devstack fails while starting monasca-api in queen/ubuntu 16.04

Bug #1728530 reported by Anilkumar Thovi
6
This bug affects 1 person
Affects Status Importance Assigned to Milestone
Monasca
New
Undecided
Unassigned

Bug Description

devstack installation ./stack.sh fails while starting monasca-api in queen/ubuntu 16.04,but even though the monasca-api process started.

/*************************************************************************

++functions-common:run_process:1508 is_service_enabled monasca-api
++functions-common:is_service_enabled:1851 local xtrace
+++functions-common:is_service_enabled:1852 set +o
+++functions-common:is_service_enabled:1852 grep xtrace
++functions-common:is_service_enabled:1852 xtrace='set -o xtrace'
++functions-common:is_service_enabled:1853 set +o xtrace
++functions-common:is_service_enabled:1881 return 0
++functions-common:run_process:1509 _run_under_systemd monasca-api '/usr/local/bin/gunicorn --paste /etc/monasca/api-config.ini' '' ''
++functions-common:_run_under_systemd:1465 local service=monasca-api
++functions-common:_run_under_systemd:1466 local 'command=/usr/local/bin/gunicorn --paste /etc/monasca/api-config.ini'
++functions-common:_run_under_systemd:1467 local 'cmd=/usr/local/bin/gunicorn --paste /etc/monasca/api-config.ini'
++functions-common:_run_under_systemd:1469 _common_systemd_pitfalls '/usr/local/bin/gunicorn --paste /etc/monasca/api-config.ini'
++functions-common:_common_systemd_pitfalls:1437 local 'cmd=/usr/local/bin/gunicorn --paste /etc/monasca/api-config.ini'
++functions-common:_common_systemd_pitfalls:1440 [[ /usr/local/bin/gunicorn --paste /etc/monasca/api-config.ini =~ sudo ]]
++functions-common:_common_systemd_pitfalls:1451 [[ ! /usr/local/bin/gunicorn --paste /etc/monasca/api-config.ini =~ ^/ ]]
++functions-common:_run_under_systemd:1471 local <email address hidden>
++functions-common:_run_under_systemd:1472 local group=
++functions-common:_run_under_systemd:1473 local user=stack
++functions-common:_run_under_systemd:1474 [[ /usr/local/bin/gunicorn --paste /etc/monasca/api-config.ini =~ uwsgi ]]
++functions-common:_run_under_systemd:1477 write_user_unit_file <email address hidden> '/usr/local/bin/gunicorn --paste /etc/monasca/api-config.ini' '' stack
++functions-common:write_user_unit_file:1382 local <email address hidden>
++functions-common:write_user_unit_file:1383 local 'command=/usr/local/bin/gunicorn --paste /etc/monasca/api-config.ini'
++functions-common:write_user_unit_file:1384 local group=
++functions-common:write_user_unit_file:1385 local user=stack
++functions-common:write_user_unit_file:1386 local extra=
++functions-common:write_user_unit_file:1387 [[ -n '' ]]
++functions-common:write_user_unit_file:1390 local <email address hidden>
++functions-common:write_user_unit_file:1391 mkdir -p /etc/systemd/system
++functions-common:write_user_unit_file:1393 iniset -sudo /<email address hidden> Unit Description 'Devstack <email address hidden>'
++inc/ini-config:iniset:172 local xtrace
+++inc/ini-config:iniset:173 grep xtrace
+++inc/ini-config:iniset:173 set +o
++inc/ini-config:iniset:173 xtrace='set -o xtrace'
++inc/ini-config:iniset:174 set +o xtrace
++functions-common:write_user_unit_file:1394 iniset -sudo /<email address hidden> Service User stack
++inc/ini-config:iniset:172 local xtrace
+++inc/ini-config:iniset:173 grep xtrace
+++inc/ini-config:iniset:173 set +o
++inc/ini-config:iniset:173 xtrace='set -o xtrace'
++inc/ini-config:iniset:174 set +o xtrace
++functions-common:write_user_unit_file:1395 iniset -sudo /<email address hidden> Service ExecStart '/usr/local/bin/gunicorn --paste /etc/monasca/api-config.ini'
++inc/ini-config:iniset:172 local xtrace
+++inc/ini-config:iniset:173 set +o
+++inc/ini-config:iniset:173 grep xtrace
++inc/ini-config:iniset:173 xtrace='set -o xtrace'
++inc/ini-config:iniset:174 set +o xtrace
++functions-common:write_user_unit_file:1396 iniset -sudo /<email address hidden> Service KillMode process
++inc/ini-config:iniset:172 local xtrace
+++inc/ini-config:iniset:173 grep xtrace
+++inc/ini-config:iniset:173 set +o
++inc/ini-config:iniset:173 xtrace='set -o xtrace'
++inc/ini-config:iniset:174 set +o xtrace
++functions-common:write_user_unit_file:1397 iniset -sudo /<email address hidden> Service TimeoutStopSec infinity
++inc/ini-config:iniset:172 local xtrace
+++inc/ini-config:iniset:173 grep xtrace
+++inc/ini-config:iniset:173 set +o
++inc/ini-config:iniset:173 xtrace='set -o xtrace'
++inc/ini-config:iniset:174 set +o xtrace
++functions-common:write_user_unit_file:1398 iniset -sudo /<email address hidden> Service ExecReload '/bin/kill -HUP $MAINPID'
++inc/ini-config:iniset:172 local xtrace
+++inc/ini-config:iniset:173 grep xtrace
+++inc/ini-config:iniset:173 set +o
++inc/ini-config:iniset:173 xtrace='set -o xtrace'
++inc/ini-config:iniset:174 set +o xtrace
++functions-common:write_user_unit_file:1399 [[ -n '' ]]
++functions-common:write_user_unit_file:1402 iniset -sudo /<email address hidden> Install WantedBy multi-user.target
++inc/ini-config:iniset:172 local xtrace
+++inc/ini-config:iniset:173 set +o
+++inc/ini-config:iniset:173 grep xtrace
++inc/ini-config:iniset:173 xtrace='set -o xtrace'
++inc/ini-config:iniset:174 set +o xtrace
++functions-common:write_user_unit_file:1405 sudo systemctl daemon-reload
++functions-common:_run_under_systemd:1480 sudo systemctl enable <email address hidden>
Created symlink from /<email address hidden> to /<email address hidden>.
++functions-common:_run_under_systemd:1481 sudo systemctl start <email address hidden>
++functions-common:run_process:1511 time_stop run_process
++functions-common:time_stop:2224 local name
++functions-common:time_stop:2225 local end_time
++functions-common:time_stop:2226 local elapsed_time
++functions-common:time_stop:2227 local total
++functions-common:time_stop:2228 local start_time
++functions-common:time_stop:2230 name=run_process
++functions-common:time_stop:2231 start_time=1509192401670
++functions-common:time_stop:2233 [[ -z 1509192401670 ]]
+++functions-common:time_stop:2236 date +%s%3N
++functions-common:time_stop:2236 end_time=1509192404791
++functions-common:time_stop:2237 elapsed_time=3121
++functions-common:time_stop:2238 total=99404
++functions-common:time_stop:2240 _TIME_START[$name]=
++functions-common:time_stop:2241 _TIME_TOTAL[$name]=102525
++/opt/stack/monasca-api/devstack/plugin.sh:start_monasca_api_python:843 echo 'Waiting for monasca-api to start...'
Waiting for monasca-api to start...
++/opt/stack/monasca-api/devstack/plugin.sh:start_monasca_api_python:844 wait_for_service 60 http://10.0.2.15:8070
++functions:wait_for_service:428 local timeout=60
++functions:wait_for_service:429 local url=http://10.0.2.15:8070
++functions:wait_for_service:430 local rval=0
++functions:wait_for_service:431 time_start wait_for_service
++functions-common:time_start:2210 local name=wait_for_service
++functions-common:time_start:2211 local start_time=
++functions-common:time_start:2212 [[ -n '' ]]
+++functions-common:time_start:2215 date +%s%3N
++functions-common:time_start:2215 _TIME_START[$name]=1509192405227
++functions:wait_for_service:432 timeout 60 bash -x
++:: curl -g -k --noproxy '*' -s -o /dev/null -w '%{http_code}' http://10.0.2.15:8070
+:: [[ 000 == 503 ]]
+:: [[ 7 -eq 7 ]]
+:: sleep 1
++:: curl -g -k --noproxy '*' -s -o /dev/null -w '%{http_code}' http://10.0.2.15:8070
+:: [[ 000 == 503 ]]
+:: [[ 7 -eq 7 ]]
+:: sleep 1
++:: curl -g -k --noproxy '*' -s -o /dev/null -w '%{http_code}' http://10.0.2.15:8070
+:: [[ 000 == 503 ]]
+:: [[ 7 -eq 7 ]]
+:: sleep 1
++:: curl -g -k --noproxy '*' -s -o /dev/null -w '%{http_code}' http://10.0.2.15:8070
+:: [[ 000 == 503 ]]
+:: [[ 7 -eq 7 ]]
+:: sleep 1
++:: curl -g -k --noproxy '*' -s -o /dev/null -w '%{http_code}' http://10.0.2.15:8070
+:: [[ 000 == 503 ]]
+:: [[ 7 -eq 7 ]]
+:: sleep 1
++:: curl -g -k --noproxy '*' -s -o /dev/null -w '%{http_code}' http://10.0.2.15:8070
+:: [[ 000 == 503 ]]
+:: [[ 7 -eq 7 ]]
+:: sleep 1
++:: curl -g -k --noproxy '*' -s -o /dev/null -w '%{http_code}' http://10.0.2.15:8070
+:: [[ 000 == 503 ]]
+:: [[ 7 -eq 7 ]]
+:: sleep 1
++:: curl -g -k --noproxy '*' -s -o /dev/null -w '%{http_code}' http://10.0.2.15:8070
++functions:wait_for_service:432 rval=124
++functions:wait_for_service:437 time_stop wait_for_service
++functions-common:time_stop:2224 local name
++functions-common:time_stop:2225 local end_time
++functions-common:time_stop:2226 local elapsed_time
++functions-common:time_stop:2227 local total
++functions-common:time_stop:2228 local start_time
++functions-common:time_stop:2230 name=wait_for_service
++functions-common:time_stop:2231 start_time=1509192405227
++functions-common:time_stop:2233 [[ -z 1509192405227 ]]
+++functions-common:time_stop:2236 date +%s%3N
++functions-common:time_stop:2236 end_time=1509192465630
++functions-common:time_stop:2237 elapsed_time=60403
++functions-common:time_stop:2238 total=102915
++functions-common:time_stop:2240 _TIME_START[$name]=
++functions-common:time_stop:2241 _TIME_TOTAL[$name]=163318
++functions:wait_for_service:438 return 124
++/opt/stack/monasca-api/devstack/plugin.sh:start_monasca_api_python:845 die 845 'monasca-api did not start'
++functions-common:die:187 local exitcode=0
++functions-common:die:188 set +o xtrace
[Call Trace]
./stack.sh:1357:run_phase
/opt/stack/devstack/functions-common:1704:run_plugins
/opt/stack/devstack/functions-common:1671:source
/opt/stack/monasca-api/devstack/plugin.sh:1361:extra_monasca
/opt/stack/monasca-api/devstack/plugin.sh:168:start_monasca_services
/opt/stack/monasca-api/devstack/plugin.sh:175:start_monasca_api
/opt/stack/monasca-api/devstack/plugin.sh:899:start_monasca_api_python
/opt/stack/monasca-api/devstack/plugin.sh:845:die
[ERROR] /opt/stack/monasca-api/devstack/plugin.sh:845 monasca-api did not start
Error on exit
World dumping... see /opt/stack/logs/worlddump-2017-10-28-120748.txt for details

****************************************************************************

mon-zun@monzun-VirtualBox:~$ sudo systemctl status <email address hidden>
[sudo] password for mon-zun:
● <email address hidden> - Devstack <email address hidden>
   Loaded: loaded (/<email address hidden>; enabled; ve
   Active: active (running) since Sat 2017-10-28 17:36:44 IST; 1h 39min ago
 Main PID: 28934 (gunicorn)
   CGroup: /<email address hidden>
           ├─28934 /usr/bin/python /usr/local/bin/gunicorn --paste /etc/monasca/
           ├─29360 /usr/bin/python /usr/local/bin/gunicorn --paste /etc/monasca/
           └─29361 /usr/bin/python /usr/local/bin/gunicorn --paste /etc/monasca/

Oct 28 19:06:24 monzun-VirtualBox gunicorn[28934]: ": "bb64aa17f34e4e9295c55edb5
Oct 28 19:06:24 monzun-VirtualBox gunicorn[28934]: 2017-10-28 19:06:24,823.823 2
Oct 28 19:06:24 monzun-VirtualBox gunicorn[28934]: 2017-10-28 19:06:24,831.831 2
Oct 28 19:06:24 monzun-VirtualBox gunicorn[28934]: 2017-10-28 19:06:24,839.839 2
Oct 28 19:06:24 monzun-VirtualBox gunicorn[28934]: 2017-10-28 19:06:24,983.983 2
Oct 28 19:06:24 monzun-VirtualBox gunicorn[28934]: 2017-10-28 19:06:24,990.990 2
Oct 28 19:06:24 monzun-VirtualBox gunicorn[28934]: RESP BODY: {"token": {"is_dom
Oct 28 19:06:25 monzun-VirtualBox gunicorn[28934]: _http_log_response /usr/loca
Oct 28 19:06:25 monzun-VirtualBox gunicorn[28934]: 2017-10-28 19:06:24,991.991 2
Oct 28 19:06:25 monzun-VirtualBox gunicorn[28934]: 2017-10-28 19:06:24,995.995 2

**************************************************************************/

affects: devstack → monasca
To post a comment you must log in.
This report contains Public information  
Everyone can see this information.

Other bug subscribers

Remote bug watches

Bug watches keep track of this bug in other bug trackers.