2017-11-16 02:21:18,520 [salt.cli.daemons ][WARNING ][2504] IMPORTANT: Do not use md5 hashing algorithm! Please set "hash_type" to sha256 in Salt Minion config!
2017-11-16 02:21:27,740 [salt.state       ][ERROR   ][3749] No contents found in top file
2017-11-16 02:23:16,769 [salt.utils.parsers][WARNING ][2504] Minion received a SIGTERM. Exiting.
2017-11-16 02:25:30,909 [salt.cli.daemons ][WARNING ][3155] IMPORTANT: Do not use md5 hashing algorithm! Please set "hash_type" to sha256 in Salt Minion config!
2017-11-16 02:28:33,366 [py.warnings      ][WARNING ][15041] /usr/lib/python2.7/dist-packages/salt/utils/templates.py:73: DeprecationWarning: Starting in 2015.5, cmd.run uses python_shell=False by default, which doesn't support shellisms (pipes, env variables, etc). cmd.run is currently aliased to cmd.shell to prevent breakage. Please switch to cmd.shell or set python_shell=True to avoid breakage in the future, when this aliasing is removed.

2017-11-16 02:31:48,345 [salt.loaded.int.module.cmdmod][ERROR   ][15041] Command 'sfdisk -d /dev/nbd9' failed with return code: 1
2017-11-16 02:31:48,345 [salt.loaded.int.module.cmdmod][ERROR   ][15041] output: sfdisk: cannot open /dev/nbd9: Inappropriate ioctl for device
2017-11-16 02:31:54,355 [salt.loaded.int.module.cmdmod][ERROR   ][15041] Command 'sfdisk -d /dev/nbd9' failed with return code: 1
2017-11-16 02:31:54,356 [salt.loaded.int.module.cmdmod][ERROR   ][15041] output: sfdisk: cannot open /dev/nbd9: Inappropriate ioctl for device
2017-11-16 02:32:02,525 [salt.loaded.int.module.cmdmod][ERROR   ][15041] Command 'sfdisk -d /dev/nbd9' failed with return code: 1
2017-11-16 02:32:02,526 [salt.loaded.int.module.cmdmod][ERROR   ][15041] output: sfdisk: cannot open /dev/nbd9: Inappropriate ioctl for device
2017-11-16 02:32:11,174 [salt.loaded.int.module.cmdmod][ERROR   ][15041] Command 'sfdisk -d /dev/nbd9' failed with return code: 1
2017-11-16 02:32:11,174 [salt.loaded.int.module.cmdmod][ERROR   ][15041] output: sfdisk: cannot open /dev/nbd9: Inappropriate ioctl for device
2017-11-16 02:32:17,231 [salt.loaded.int.module.cmdmod][ERROR   ][15041] Command 'while true; do salt-call saltutil.running|grep fun: && continue; salt-call --local service.restart salt-minion; break; done' failed with return code: None
2017-11-16 02:32:19,457 [salt.loaded.int.module.cmdmod][INFO    ][22318] Executing command ['systemctl', 'status', 'salt-minion.service', '-n', '0'] in directory '/root'
2017-11-16 02:32:19,463 [salt.loaded.int.module.cmdmod][INFO    ][22318] Executing command ['systemctl', 'is-enabled', 'salt-minion.service'] in directory '/root'
2017-11-16 02:32:19,471 [salt.loaded.int.module.cmdmod][INFO    ][22318] Executing command ['systemd-run', '--scope', 'systemctl', 'restart', 'salt-minion.service'] in directory '/root'
2017-11-16 02:32:19,478 [salt.utils.parsers][WARNING ][3155] Minion received a SIGTERM. Exiting.
2017-11-16 02:32:19,725 [salt.cli.daemons ][INFO    ][22407] Setting up the Salt Minion "kvm02.baremetal-mcp-ocata-ovs-ha.local"
2017-11-16 02:32:20,269 [salt.minion      ][INFO    ][22407] Creating minion process manager
2017-11-16 02:32:20,270 [salt.cli.daemons ][WARNING ][22407] IMPORTANT: Do not use md5 hashing algorithm! Please set "hash_type" to sha256 in Salt Minion config!
2017-11-16 02:32:20,270 [salt.cli.daemons ][INFO    ][22407] The Salt Minion is starting up
2017-11-16 02:32:20,270 [salt.minion      ][INFO    ][22407] Minion is starting as user 'root'
2017-11-16 02:32:20,270 [salt.utils.event ][INFO    ][22407] Starting pull socket on /var/run/salt/minion/minion_event_a1b2f32648_pull.ipc
2017-11-16 02:32:21,138 [salt.loaded.int.module.cmdmod][INFO    ][22407] Executing command ['date', '+%z'] in directory '/root'
2017-11-16 02:32:21,146 [salt.utils.schedule][INFO    ][22407] Updating job settings for scheduled job: __mine_interval
2017-11-16 02:32:21,149 [salt.minion      ][INFO    ][22407] Added mine.update to scheduler
2017-11-16 02:32:21,350 [salt.minion      ][INFO    ][22407] Minion is ready to receive requests!
2017-11-16 02:32:22,351 [salt.utils.schedule][INFO    ][22407] Running scheduled job: __mine_interval
2017-11-16 02:32:28,977 [salt.minion      ][INFO    ][22407] User sudo_ubuntu Executing command saltutil.sync_all with jid 20171116023228972780
2017-11-16 02:32:28,991 [salt.minion      ][INFO    ][22536] Starting a new job with PID 22536
2017-11-16 02:32:30,392 [salt.state       ][INFO    ][22536] Loading fresh modules for state activity
2017-11-16 02:32:30,412 [salt.state       ][ERROR   ][22536] No contents found in top file
2017-11-16 02:32:30,420 [salt.utils.extmods][INFO    ][22536] Creating module dir '/var/cache/salt/minion/extmods/beacons'
2017-11-16 02:32:30,422 [salt.utils.extmods][INFO    ][22536] Syncing beacons for environment 'base'
2017-11-16 02:32:30,423 [salt.utils.extmods][INFO    ][22536] Loading cache from salt://_beacons, for base)
2017-11-16 02:32:30,423 [salt.fileclient  ][INFO    ][22536] Caching directory '_beacons/' for environment 'base'
2017-11-16 02:32:30,444 [salt.utils.extmods][INFO    ][22536] Syncing modules for environment 'base'
2017-11-16 02:32:30,444 [salt.utils.extmods][INFO    ][22536] Loading cache from salt://_modules, for base)
2017-11-16 02:32:30,444 [salt.fileclient  ][INFO    ][22536] Caching directory '_modules/' for environment 'base'
2017-11-16 02:32:30,473 [salt.fileclient  ][INFO    ][22536] Fetching file from saltenv 'base', ** done ** '_modules/ceph_ng.py'
2017-11-16 02:32:30,481 [salt.fileclient  ][INFO    ][22536] Fetching file from saltenv 'base', ** done ** '_modules/cinderng.py'
2017-11-16 02:32:30,490 [salt.fileclient  ][INFO    ][22536] Fetching file from saltenv 'base', ** done ** '_modules/contrail.py'
2017-11-16 02:32:30,498 [salt.fileclient  ][INFO    ][22536] Fetching file from saltenv 'base', ** done ** '_modules/creds.py'
2017-11-16 02:32:30,506 [salt.fileclient  ][INFO    ][22536] Fetching file from saltenv 'base', ** done ** '_modules/devops_utils.py'
2017-11-16 02:32:30,514 [salt.fileclient  ][INFO    ][22536] Fetching file from saltenv 'base', ** done ** '_modules/encode_json.py'
2017-11-16 02:32:30,953 [salt.fileclient  ][INFO    ][22536] Fetching file from saltenv 'base', ** done ** '_modules/gerrit.py'
2017-11-16 02:32:30,965 [salt.fileclient  ][INFO    ][22536] Fetching file from saltenv 'base', ** done ** '_modules/glanceng.py'
2017-11-16 02:32:30,976 [salt.fileclient  ][INFO    ][22536] Fetching file from saltenv 'base', ** done ** '_modules/heat.py'
2017-11-16 02:32:30,988 [salt.fileclient  ][INFO    ][22536] Fetching file from saltenv 'base', ** done ** '_modules/heka_alarming.py'
2017-11-16 02:32:30,999 [salt.fileclient  ][INFO    ][22536] Fetching file from saltenv 'base', ** done ** '_modules/helm.py'
2017-11-16 02:32:31,010 [salt.fileclient  ][INFO    ][22536] Fetching file from saltenv 'base', ** done ** '_modules/jenkins_common.py'
2017-11-16 02:32:31,021 [salt.fileclient  ][INFO    ][22536] Fetching file from saltenv 'base', ** done ** '_modules/keystone_policy.py'
2017-11-16 02:32:31,030 [salt.fileclient  ][INFO    ][22536] Fetching file from saltenv 'base', ** done ** '_modules/linux_hosts.py'
2017-11-16 02:32:31,042 [salt.fileclient  ][INFO    ][22536] Fetching file from saltenv 'base', ** done ** '_modules/linux_netlink.py'
2017-11-16 02:32:31,054 [salt.fileclient  ][INFO    ][22536] Fetching file from saltenv 'base', ** done ** '_modules/maas.py'
2017-11-16 02:32:31,065 [salt.fileclient  ][INFO    ][22536] Fetching file from saltenv 'base', ** done ** '_modules/maas_client.py'
2017-11-16 02:32:31,075 [salt.fileclient  ][INFO    ][22536] Fetching file from saltenv 'base', ** done ** '_modules/modelutils.py'
2017-11-16 02:32:31,085 [salt.fileclient  ][INFO    ][22536] Fetching file from saltenv 'base', ** done ** '_modules/multipart.py'
2017-11-16 02:32:31,330 [salt.fileclient  ][INFO    ][22536] Fetching file from saltenv 'base', ** done ** '_modules/nagios_alarming.py'
2017-11-16 02:32:31,340 [salt.fileclient  ][INFO    ][22536] Fetching file from saltenv 'base', ** done ** '_modules/neutronng.py'
2017-11-16 02:32:31,353 [salt.fileclient  ][INFO    ][22536] Fetching file from saltenv 'base', ** done ** '_modules/novang.py'
2017-11-16 02:32:31,364 [salt.fileclient  ][INFO    ][22536] Fetching file from saltenv 'base', ** done ** '_modules/reclass.py'
2017-11-16 02:32:31,376 [salt.fileclient  ][INFO    ][22536] Fetching file from saltenv 'base', ** done ** '_modules/rsyslog_util.py'
2017-11-16 02:32:31,386 [salt.fileclient  ][INFO    ][22536] Fetching file from saltenv 'base', ** done ** '_modules/rundeck.py'
2017-11-16 02:32:31,395 [salt.fileclient  ][INFO    ][22536] Fetching file from saltenv 'base', ** done ** '_modules/saltkey.py'
2017-11-16 02:32:31,423 [salt.fileclient  ][INFO    ][22536] Fetching file from saltenv 'base', ** done ** '_modules/saltresource.py'
2017-11-16 02:32:31,433 [salt.fileclient  ][INFO    ][22536] Fetching file from saltenv 'base', ** done ** '_modules/seedng.py'
2017-11-16 02:32:31,448 [salt.fileclient  ][INFO    ][22536] Fetching file from saltenv 'base', ** done ** '_modules/testing/credentials.py'
2017-11-16 02:32:31,465 [salt.fileclient  ][INFO    ][22536] Fetching file from saltenv 'base', ** done ** '_modules/testing/django.py'
2017-11-16 02:32:31,477 [salt.fileclient  ][INFO    ][22536] Fetching file from saltenv 'base', ** done ** '_modules/testing/django_client_proxy.py'
2017-11-16 02:32:31,487 [salt.fileclient  ][INFO    ][22536] Fetching file from saltenv 'base', ** done ** '_modules/utils.py'
2017-11-16 02:32:31,499 [salt.fileclient  ][INFO    ][22536] Fetching file from saltenv 'base', ** done ** '_modules/virtng.py'
2017-11-16 02:32:31,501 [salt.utils.extmods][INFO    ][22536] Copying '/var/cache/salt/minion/files/base/_modules/__init__.py' to '/var/cache/salt/minion/extmods/modules/__init__.py'
2017-11-16 02:32:31,502 [salt.utils.extmods][INFO    ][22536] Copying '/var/cache/salt/minion/files/base/_modules/ceph_ng.py' to '/var/cache/salt/minion/extmods/modules/ceph_ng.py'
2017-11-16 02:32:31,502 [salt.utils.extmods][INFO    ][22536] Copying '/var/cache/salt/minion/files/base/_modules/cinderng.py' to '/var/cache/salt/minion/extmods/modules/cinderng.py'
2017-11-16 02:32:31,502 [salt.utils.extmods][INFO    ][22536] Copying '/var/cache/salt/minion/files/base/_modules/contrail.py' to '/var/cache/salt/minion/extmods/modules/contrail.py'
2017-11-16 02:32:31,503 [salt.utils.extmods][INFO    ][22536] Copying '/var/cache/salt/minion/files/base/_modules/creds.py' to '/var/cache/salt/minion/extmods/modules/creds.py'
2017-11-16 02:32:31,503 [salt.utils.extmods][INFO    ][22536] Copying '/var/cache/salt/minion/files/base/_modules/devops_utils.py' to '/var/cache/salt/minion/extmods/modules/devops_utils.py'
2017-11-16 02:32:31,503 [salt.utils.extmods][INFO    ][22536] Copying '/var/cache/salt/minion/files/base/_modules/encode_json.py' to '/var/cache/salt/minion/extmods/modules/encode_json.py'
2017-11-16 02:32:31,503 [salt.utils.extmods][INFO    ][22536] Copying '/var/cache/salt/minion/files/base/_modules/gerrit.py' to '/var/cache/salt/minion/extmods/modules/gerrit.py'
2017-11-16 02:32:31,504 [salt.utils.extmods][INFO    ][22536] Copying '/var/cache/salt/minion/files/base/_modules/glanceng.py' to '/var/cache/salt/minion/extmods/modules/glanceng.py'
2017-11-16 02:32:31,504 [salt.utils.extmods][INFO    ][22536] Copying '/var/cache/salt/minion/files/base/_modules/heat.py' to '/var/cache/salt/minion/extmods/modules/heat.py'
2017-11-16 02:32:31,504 [salt.utils.extmods][INFO    ][22536] Copying '/var/cache/salt/minion/files/base/_modules/heka_alarming.py' to '/var/cache/salt/minion/extmods/modules/heka_alarming.py'
2017-11-16 02:32:31,505 [salt.utils.extmods][INFO    ][22536] Copying '/var/cache/salt/minion/files/base/_modules/helm.py' to '/var/cache/salt/minion/extmods/modules/helm.py'
2017-11-16 02:32:31,505 [salt.utils.extmods][INFO    ][22536] Copying '/var/cache/salt/minion/files/base/_modules/jenkins_common.py' to '/var/cache/salt/minion/extmods/modules/jenkins_common.py'
2017-11-16 02:32:31,505 [salt.utils.extmods][INFO    ][22536] Copying '/var/cache/salt/minion/files/base/_modules/keystone_policy.py' to '/var/cache/salt/minion/extmods/modules/keystone_policy.py'
2017-11-16 02:32:31,505 [salt.utils.extmods][INFO    ][22536] Copying '/var/cache/salt/minion/files/base/_modules/linux_hosts.py' to '/var/cache/salt/minion/extmods/modules/linux_hosts.py'
2017-11-16 02:32:31,506 [salt.utils.extmods][INFO    ][22536] Copying '/var/cache/salt/minion/files/base/_modules/linux_netlink.py' to '/var/cache/salt/minion/extmods/modules/linux_netlink.py'
2017-11-16 02:32:31,523 [salt.utils.extmods][INFO    ][22536] Copying '/var/cache/salt/minion/files/base/_modules/maas.py' to '/var/cache/salt/minion/extmods/modules/maas.py'
2017-11-16 02:32:31,523 [salt.utils.extmods][INFO    ][22536] Copying '/var/cache/salt/minion/files/base/_modules/maas_client.py' to '/var/cache/salt/minion/extmods/modules/maas_client.py'
2017-11-16 02:32:31,523 [salt.utils.extmods][INFO    ][22536] Copying '/var/cache/salt/minion/files/base/_modules/modelutils.py' to '/var/cache/salt/minion/extmods/modules/modelutils.py'
2017-11-16 02:32:31,524 [salt.utils.extmods][INFO    ][22536] Copying '/var/cache/salt/minion/files/base/_modules/multipart.py' to '/var/cache/salt/minion/extmods/modules/multipart.py'
2017-11-16 02:32:31,524 [salt.utils.extmods][INFO    ][22536] Copying '/var/cache/salt/minion/files/base/_modules/nagios_alarming.py' to '/var/cache/salt/minion/extmods/modules/nagios_alarming.py'
2017-11-16 02:32:31,524 [salt.utils.extmods][INFO    ][22536] Copying '/var/cache/salt/minion/files/base/_modules/neutronng.py' to '/var/cache/salt/minion/extmods/modules/neutronng.py'
2017-11-16 02:32:31,524 [salt.utils.extmods][INFO    ][22536] Copying '/var/cache/salt/minion/files/base/_modules/novang.py' to '/var/cache/salt/minion/extmods/modules/novang.py'
2017-11-16 02:32:31,525 [salt.utils.extmods][INFO    ][22536] Copying '/var/cache/salt/minion/files/base/_modules/reclass.py' to '/var/cache/salt/minion/extmods/modules/reclass.py'
2017-11-16 02:32:31,525 [salt.utils.extmods][INFO    ][22536] Copying '/var/cache/salt/minion/files/base/_modules/rsyslog_util.py' to '/var/cache/salt/minion/extmods/modules/rsyslog_util.py'
2017-11-16 02:32:31,526 [salt.utils.extmods][INFO    ][22536] Copying '/var/cache/salt/minion/files/base/_modules/rundeck.py' to '/var/cache/salt/minion/extmods/modules/rundeck.py'
2017-11-16 02:32:31,526 [salt.utils.extmods][INFO    ][22536] Copying '/var/cache/salt/minion/files/base/_modules/saltkey.py' to '/var/cache/salt/minion/extmods/modules/saltkey.py'
2017-11-16 02:32:31,526 [salt.utils.extmods][INFO    ][22536] Copying '/var/cache/salt/minion/files/base/_modules/saltresource.py' to '/var/cache/salt/minion/extmods/modules/saltresource.py'
2017-11-16 02:32:31,526 [salt.utils.extmods][INFO    ][22536] Copying '/var/cache/salt/minion/files/base/_modules/seedng.py' to '/var/cache/salt/minion/extmods/modules/seedng.py'
2017-11-16 02:32:31,527 [salt.utils.extmods][INFO    ][22536] Copying '/var/cache/salt/minion/files/base/_modules/testing/__init__.py' to '/var/cache/salt/minion/extmods/modules/testing/__init__.py'
2017-11-16 02:32:31,527 [salt.utils.extmods][INFO    ][22536] Copying '/var/cache/salt/minion/files/base/_modules/testing/credentials.py' to '/var/cache/salt/minion/extmods/modules/testing/credentials.py'
2017-11-16 02:32:31,527 [salt.utils.extmods][INFO    ][22536] Copying '/var/cache/salt/minion/files/base/_modules/testing/django.py' to '/var/cache/salt/minion/extmods/modules/testing/django.py'
2017-11-16 02:32:31,528 [salt.utils.extmods][INFO    ][22536] Copying '/var/cache/salt/minion/files/base/_modules/testing/django_client_proxy.py' to '/var/cache/salt/minion/extmods/modules/testing/django_client_proxy.py'
2017-11-16 02:32:31,528 [salt.utils.extmods][INFO    ][22536] Copying '/var/cache/salt/minion/files/base/_modules/utils.py' to '/var/cache/salt/minion/extmods/modules/utils.py'
2017-11-16 02:32:31,528 [salt.utils.extmods][INFO    ][22536] Copying '/var/cache/salt/minion/files/base/_modules/virtng.py' to '/var/cache/salt/minion/extmods/modules/virtng.py'
2017-11-16 02:32:31,533 [salt.utils.extmods][INFO    ][22536] Syncing states for environment 'base'
2017-11-16 02:32:31,533 [salt.utils.extmods][INFO    ][22536] Loading cache from salt://_states, for base)
2017-11-16 02:32:31,533 [salt.fileclient  ][INFO    ][22536] Caching directory '_states/' for environment 'base'
2017-11-16 02:32:31,566 [salt.fileclient  ][INFO    ][22536] Fetching file from saltenv 'base', ** done ** '_states/cinderng.py'
2017-11-16 02:32:31,576 [salt.fileclient  ][INFO    ][22536] Fetching file from saltenv 'base', ** done ** '_states/contrail.py'
2017-11-16 02:32:31,586 [salt.fileclient  ][INFO    ][22536] Fetching file from saltenv 'base', ** done ** '_states/gerrit.py'
2017-11-16 02:32:31,596 [salt.fileclient  ][INFO    ][22536] Fetching file from saltenv 'base', ** done ** '_states/glanceng.py'
2017-11-16 02:32:31,669 [salt.fileclient  ][INFO    ][22536] Fetching file from saltenv 'base', ** done ** '_states/grafana3_dashboard.py'
2017-11-16 02:32:31,679 [salt.fileclient  ][INFO    ][22536] Fetching file from saltenv 'base', ** done ** '_states/grafana3_datasource.py'
2017-11-16 02:32:31,690 [salt.fileclient  ][INFO    ][22536] Fetching file from saltenv 'base', ** done ** '_states/heat.py'
2017-11-16 02:32:31,700 [salt.fileclient  ][INFO    ][22536] Fetching file from saltenv 'base', ** done ** '_states/helm_release.py'
2017-11-16 02:32:31,724 [salt.fileclient  ][INFO    ][22536] Fetching file from saltenv 'base', ** done ** '_states/jenkins_approval.py'
2017-11-16 02:32:31,735 [salt.fileclient  ][INFO    ][22536] Fetching file from saltenv 'base', ** done ** '_states/jenkins_artifactory.py'
2017-11-16 02:32:31,745 [salt.fileclient  ][INFO    ][22536] Fetching file from saltenv 'base', ** done ** '_states/jenkins_credential.py'
2017-11-16 02:32:31,772 [salt.fileclient  ][INFO    ][22536] Fetching file from saltenv 'base', ** done ** '_states/jenkins_job.py'
2017-11-16 02:32:31,782 [salt.fileclient  ][INFO    ][22536] Fetching file from saltenv 'base', ** done ** '_states/jenkins_lib.py'
2017-11-16 02:32:31,793 [salt.fileclient  ][INFO    ][22536] Fetching file from saltenv 'base', ** done ** '_states/jenkins_node.py'
2017-11-16 02:32:31,803 [salt.fileclient  ][INFO    ][22536] Fetching file from saltenv 'base', ** done ** '_states/jenkins_plugin.py'
2017-11-16 02:32:31,814 [salt.fileclient  ][INFO    ][22536] Fetching file from saltenv 'base', ** done ** '_states/jenkins_security.py'
2017-11-16 02:32:31,838 [salt.fileclient  ][INFO    ][22536] Fetching file from saltenv 'base', ** done ** '_states/jenkins_slack.py'
2017-11-16 02:32:31,850 [salt.fileclient  ][INFO    ][22536] Fetching file from saltenv 'base', ** done ** '_states/jenkins_smtp.py'
2017-11-16 02:32:31,861 [salt.fileclient  ][INFO    ][22536] Fetching file from saltenv 'base', ** done ** '_states/jenkins_theme.py'
2017-11-16 02:32:31,880 [salt.fileclient  ][INFO    ][22536] Fetching file from saltenv 'base', ** done ** '_states/jenkins_user.py'
2017-11-16 02:32:31,891 [salt.fileclient  ][INFO    ][22536] Fetching file from saltenv 'base', ** done ** '_states/jenkins_view.py'
2017-11-16 02:32:31,903 [salt.fileclient  ][INFO    ][22536] Fetching file from saltenv 'base', ** done ** '_states/keystone_policy.py'
2017-11-16 02:32:31,918 [salt.fileclient  ][INFO    ][22536] Fetching file from saltenv 'base', ** done ** '_states/kibana_object.py'
2017-11-16 02:32:31,937 [salt.fileclient  ][INFO    ][22536] Fetching file from saltenv 'base', ** done ** '_states/neutronng.py'
2017-11-16 02:32:31,947 [salt.fileclient  ][INFO    ][22536] Fetching file from saltenv 'base', ** done ** '_states/novang.py'
2017-11-16 02:32:31,970 [salt.fileclient  ][INFO    ][22536] Fetching file from saltenv 'base', ** done ** '_states/reclass.py'
2017-11-16 02:32:31,980 [salt.fileclient  ][INFO    ][22536] Fetching file from saltenv 'base', ** done ** '_states/rundeck_project.py'
2017-11-16 02:32:31,991 [salt.fileclient  ][INFO    ][22536] Fetching file from saltenv 'base', ** done ** '_states/rundeck_scm.py'
2017-11-16 02:32:32,002 [salt.fileclient  ][INFO    ][22536] Fetching file from saltenv 'base', ** done ** '_states/rundeck_secret.py'
2017-11-16 02:32:32,005 [salt.utils.extmods][INFO    ][22536] Copying '/var/cache/salt/minion/files/base/_states/cinderng.py' to '/var/cache/salt/minion/extmods/states/cinderng.py'
2017-11-16 02:32:32,021 [salt.utils.extmods][INFO    ][22536] Copying '/var/cache/salt/minion/files/base/_states/contrail.py' to '/var/cache/salt/minion/extmods/states/contrail.py'
2017-11-16 02:32:32,021 [salt.utils.extmods][INFO    ][22536] Copying '/var/cache/salt/minion/files/base/_states/gerrit.py' to '/var/cache/salt/minion/extmods/states/gerrit.py'
2017-11-16 02:32:32,022 [salt.utils.extmods][INFO    ][22536] Copying '/var/cache/salt/minion/files/base/_states/glanceng.py' to '/var/cache/salt/minion/extmods/states/glanceng.py'
2017-11-16 02:32:32,022 [salt.utils.extmods][INFO    ][22536] Copying '/var/cache/salt/minion/files/base/_states/grafana3_dashboard.py' to '/var/cache/salt/minion/extmods/states/grafana3_dashboard.py'
2017-11-16 02:32:32,022 [salt.utils.extmods][INFO    ][22536] Copying '/var/cache/salt/minion/files/base/_states/grafana3_datasource.py' to '/var/cache/salt/minion/extmods/states/grafana3_datasource.py'
2017-11-16 02:32:32,023 [salt.utils.extmods][INFO    ][22536] Copying '/var/cache/salt/minion/files/base/_states/heat.py' to '/var/cache/salt/minion/extmods/states/heat.py'
2017-11-16 02:32:32,023 [salt.utils.extmods][INFO    ][22536] Copying '/var/cache/salt/minion/files/base/_states/helm_release.py' to '/var/cache/salt/minion/extmods/states/helm_release.py'
2017-11-16 02:32:32,023 [salt.utils.extmods][INFO    ][22536] Copying '/var/cache/salt/minion/files/base/_states/jenkins_approval.py' to '/var/cache/salt/minion/extmods/states/jenkins_approval.py'
2017-11-16 02:32:32,024 [salt.utils.extmods][INFO    ][22536] Copying '/var/cache/salt/minion/files/base/_states/jenkins_artifactory.py' to '/var/cache/salt/minion/extmods/states/jenkins_artifactory.py'
2017-11-16 02:32:32,024 [salt.utils.extmods][INFO    ][22536] Copying '/var/cache/salt/minion/files/base/_states/jenkins_credential.py' to '/var/cache/salt/minion/extmods/states/jenkins_credential.py'
2017-11-16 02:32:32,025 [salt.utils.extmods][INFO    ][22536] Copying '/var/cache/salt/minion/files/base/_states/jenkins_job.py' to '/var/cache/salt/minion/extmods/states/jenkins_job.py'
2017-11-16 02:32:32,025 [salt.utils.extmods][INFO    ][22536] Copying '/var/cache/salt/minion/files/base/_states/jenkins_lib.py' to '/var/cache/salt/minion/extmods/states/jenkins_lib.py'
2017-11-16 02:32:32,025 [salt.utils.extmods][INFO    ][22536] Copying '/var/cache/salt/minion/files/base/_states/jenkins_node.py' to '/var/cache/salt/minion/extmods/states/jenkins_node.py'
2017-11-16 02:32:32,026 [salt.utils.extmods][INFO    ][22536] Copying '/var/cache/salt/minion/files/base/_states/jenkins_plugin.py' to '/var/cache/salt/minion/extmods/states/jenkins_plugin.py'
2017-11-16 02:32:32,026 [salt.utils.extmods][INFO    ][22536] Copying '/var/cache/salt/minion/files/base/_states/jenkins_security.py' to '/var/cache/salt/minion/extmods/states/jenkins_security.py'
2017-11-16 02:32:32,026 [salt.utils.extmods][INFO    ][22536] Copying '/var/cache/salt/minion/files/base/_states/jenkins_slack.py' to '/var/cache/salt/minion/extmods/states/jenkins_slack.py'
2017-11-16 02:32:32,027 [salt.utils.extmods][INFO    ][22536] Copying '/var/cache/salt/minion/files/base/_states/jenkins_smtp.py' to '/var/cache/salt/minion/extmods/states/jenkins_smtp.py'
2017-11-16 02:32:32,027 [salt.utils.extmods][INFO    ][22536] Copying '/var/cache/salt/minion/files/base/_states/jenkins_theme.py' to '/var/cache/salt/minion/extmods/states/jenkins_theme.py'
2017-11-16 02:32:32,027 [salt.utils.extmods][INFO    ][22536] Copying '/var/cache/salt/minion/files/base/_states/jenkins_user.py' to '/var/cache/salt/minion/extmods/states/jenkins_user.py'
2017-11-16 02:32:32,028 [salt.utils.extmods][INFO    ][22536] Copying '/var/cache/salt/minion/files/base/_states/jenkins_view.py' to '/var/cache/salt/minion/extmods/states/jenkins_view.py'
2017-11-16 02:32:32,028 [salt.utils.extmods][INFO    ][22536] Copying '/var/cache/salt/minion/files/base/_states/keystone_policy.py' to '/var/cache/salt/minion/extmods/states/keystone_policy.py'
2017-11-16 02:32:32,028 [salt.utils.extmods][INFO    ][22536] Copying '/var/cache/salt/minion/files/base/_states/kibana_object.py' to '/var/cache/salt/minion/extmods/states/kibana_object.py'
2017-11-16 02:32:32,029 [salt.utils.extmods][INFO    ][22536] Copying '/var/cache/salt/minion/files/base/_states/maas_cluster.py' to '/var/cache/salt/minion/extmods/states/maas_cluster.py'
2017-11-16 02:32:32,029 [salt.utils.extmods][INFO    ][22536] Copying '/var/cache/salt/minion/files/base/_states/neutronng.py' to '/var/cache/salt/minion/extmods/states/neutronng.py'
2017-11-16 02:32:32,030 [salt.utils.extmods][INFO    ][22536] Copying '/var/cache/salt/minion/files/base/_states/novang.py' to '/var/cache/salt/minion/extmods/states/novang.py'
2017-11-16 02:32:32,030 [salt.utils.extmods][INFO    ][22536] Copying '/var/cache/salt/minion/files/base/_states/reclass.py' to '/var/cache/salt/minion/extmods/states/reclass.py'
2017-11-16 02:32:32,030 [salt.utils.extmods][INFO    ][22536] Copying '/var/cache/salt/minion/files/base/_states/rundeck_project.py' to '/var/cache/salt/minion/extmods/states/rundeck_project.py'
2017-11-16 02:32:32,031 [salt.utils.extmods][INFO    ][22536] Copying '/var/cache/salt/minion/files/base/_states/rundeck_scm.py' to '/var/cache/salt/minion/extmods/states/rundeck_scm.py'
2017-11-16 02:32:32,031 [salt.utils.extmods][INFO    ][22536] Copying '/var/cache/salt/minion/files/base/_states/rundeck_secret.py' to '/var/cache/salt/minion/extmods/states/rundeck_secret.py'
2017-11-16 02:32:32,033 [salt.utils.extmods][INFO    ][22536] Creating module dir '/var/cache/salt/minion/extmods/sdb'
2017-11-16 02:32:32,036 [salt.utils.extmods][INFO    ][22536] Syncing sdb for environment 'base'
2017-11-16 02:32:32,036 [salt.utils.extmods][INFO    ][22536] Loading cache from salt://_sdb, for base)
2017-11-16 02:32:32,036 [salt.fileclient  ][INFO    ][22536] Caching directory '_sdb/' for environment 'base'
2017-11-16 02:32:32,064 [salt.utils.extmods][INFO    ][22536] Syncing grains for environment 'base'
2017-11-16 02:32:32,064 [salt.utils.extmods][INFO    ][22536] Loading cache from salt://_grains, for base)
2017-11-16 02:32:32,064 [salt.fileclient  ][INFO    ][22536] Caching directory '_grains/' for environment 'base'
2017-11-16 02:32:32,105 [salt.fileclient  ][INFO    ][22536] Fetching file from saltenv 'base', ** done ** '_grains/ceilometer_policy.py'
2017-11-16 02:32:32,117 [salt.fileclient  ][INFO    ][22536] Fetching file from saltenv 'base', ** done ** '_grains/ceph.py'
2017-11-16 02:32:32,128 [salt.fileclient  ][INFO    ][22536] Fetching file from saltenv 'base', ** done ** '_grains/cinder_policy.py'
2017-11-16 02:32:32,140 [salt.fileclient  ][INFO    ][22536] Fetching file from saltenv 'base', ** done ** '_grains/docker_swarm.py'
2017-11-16 02:32:32,151 [salt.fileclient  ][INFO    ][22536] Fetching file from saltenv 'base', ** done ** '_grains/glance_policy.py'
2017-11-16 02:32:32,168 [salt.fileclient  ][INFO    ][22536] Fetching file from saltenv 'base', ** done ** '_grains/heat_policy.py'
2017-11-16 02:32:32,179 [salt.fileclient  ][INFO    ][22536] Fetching file from saltenv 'base', ** done ** '_grains/jenkins_plugins.py'
2017-11-16 02:32:32,207 [salt.fileclient  ][INFO    ][22536] Fetching file from saltenv 'base', ** done ** '_grains/keystone_policy.py'
2017-11-16 02:32:32,218 [salt.fileclient  ][INFO    ][22536] Fetching file from saltenv 'base', ** done ** '_grains/kubernetes.py'
2017-11-16 02:32:32,230 [salt.fileclient  ][INFO    ][22536] Fetching file from saltenv 'base', ** done ** '_grains/neutron_policy.py'
2017-11-16 02:32:32,241 [salt.fileclient  ][INFO    ][22536] Fetching file from saltenv 'base', ** done ** '_grains/nova_policy.py'
2017-11-16 02:32:32,252 [salt.fileclient  ][INFO    ][22536] Fetching file from saltenv 'base', ** done ** '_grains/ssh_fingerprints.py'
2017-11-16 02:32:32,254 [salt.utils.extmods][INFO    ][22536] Copying '/var/cache/salt/minion/files/base/_grains/ceilometer_policy.py' to '/var/cache/salt/minion/extmods/grains/ceilometer_policy.py'
2017-11-16 02:32:32,255 [salt.utils.extmods][INFO    ][22536] Copying '/var/cache/salt/minion/files/base/_grains/ceph.py' to '/var/cache/salt/minion/extmods/grains/ceph.py'
2017-11-16 02:32:32,255 [salt.utils.extmods][INFO    ][22536] Copying '/var/cache/salt/minion/files/base/_grains/cinder_policy.py' to '/var/cache/salt/minion/extmods/grains/cinder_policy.py'
2017-11-16 02:32:32,255 [salt.utils.extmods][INFO    ][22536] Copying '/var/cache/salt/minion/files/base/_grains/docker_swarm.py' to '/var/cache/salt/minion/extmods/grains/docker_swarm.py'
2017-11-16 02:32:32,255 [salt.utils.extmods][INFO    ][22536] Copying '/var/cache/salt/minion/files/base/_grains/glance_policy.py' to '/var/cache/salt/minion/extmods/grains/glance_policy.py'
2017-11-16 02:32:32,256 [salt.utils.extmods][INFO    ][22536] Copying '/var/cache/salt/minion/files/base/_grains/heat_policy.py' to '/var/cache/salt/minion/extmods/grains/heat_policy.py'
2017-11-16 02:32:32,256 [salt.utils.extmods][INFO    ][22536] Copying '/var/cache/salt/minion/files/base/_grains/jenkins_plugins.py' to '/var/cache/salt/minion/extmods/grains/jenkins_plugins.py'
2017-11-16 02:32:32,256 [salt.utils.extmods][INFO    ][22536] Copying '/var/cache/salt/minion/files/base/_grains/keystone_policy.py' to '/var/cache/salt/minion/extmods/grains/keystone_policy.py'
2017-11-16 02:32:32,256 [salt.utils.extmods][INFO    ][22536] Copying '/var/cache/salt/minion/files/base/_grains/kubernetes.py' to '/var/cache/salt/minion/extmods/grains/kubernetes.py'
2017-11-16 02:32:32,257 [salt.utils.extmods][INFO    ][22536] Copying '/var/cache/salt/minion/files/base/_grains/neutron_policy.py' to '/var/cache/salt/minion/extmods/grains/neutron_policy.py'
2017-11-16 02:32:32,257 [salt.utils.extmods][INFO    ][22536] Copying '/var/cache/salt/minion/files/base/_grains/nova_policy.py' to '/var/cache/salt/minion/extmods/grains/nova_policy.py'
2017-11-16 02:32:32,257 [salt.utils.extmods][INFO    ][22536] Copying '/var/cache/salt/minion/files/base/_grains/ssh_fingerprints.py' to '/var/cache/salt/minion/extmods/grains/ssh_fingerprints.py'
2017-11-16 02:32:32,258 [salt.utils.extmods][INFO    ][22536] Creating module dir '/var/cache/salt/minion/extmods/renderers'
2017-11-16 02:32:32,260 [salt.utils.extmods][INFO    ][22536] Syncing renderers for environment 'base'
2017-11-16 02:32:32,261 [salt.utils.extmods][INFO    ][22536] Loading cache from salt://_renderers, for base)
2017-11-16 02:32:32,261 [salt.fileclient  ][INFO    ][22536] Caching directory '_renderers/' for environment 'base'
2017-11-16 02:32:32,288 [salt.utils.extmods][INFO    ][22536] Creating module dir '/var/cache/salt/minion/extmods/returners'
2017-11-16 02:32:32,290 [salt.utils.extmods][INFO    ][22536] Syncing returners for environment 'base'
2017-11-16 02:32:32,291 [salt.utils.extmods][INFO    ][22536] Loading cache from salt://_returners, for base)
2017-11-16 02:32:32,291 [salt.fileclient  ][INFO    ][22536] Caching directory '_returners/' for environment 'base'
2017-11-16 02:32:32,328 [salt.utils.extmods][INFO    ][22536] Creating module dir '/var/cache/salt/minion/extmods/output'
2017-11-16 02:32:32,330 [salt.utils.extmods][INFO    ][22536] Syncing output for environment 'base'
2017-11-16 02:32:32,331 [salt.utils.extmods][INFO    ][22536] Loading cache from salt://_output, for base)
2017-11-16 02:32:32,331 [salt.fileclient  ][INFO    ][22536] Caching directory '_output/' for environment 'base'
2017-11-16 02:32:32,364 [salt.utils.extmods][INFO    ][22536] Creating module dir '/var/cache/salt/minion/extmods/utils'
2017-11-16 02:32:32,366 [salt.utils.extmods][INFO    ][22536] Syncing utils for environment 'base'
2017-11-16 02:32:32,366 [salt.utils.extmods][INFO    ][22536] Loading cache from salt://_utils, for base)
2017-11-16 02:32:32,366 [salt.fileclient  ][INFO    ][22536] Caching directory '_utils/' for environment 'base'
2017-11-16 02:32:32,398 [salt.utils.extmods][INFO    ][22536] Creating module dir '/var/cache/salt/minion/extmods/log_handlers'
2017-11-16 02:32:32,401 [salt.utils.extmods][INFO    ][22536] Syncing log_handlers for environment 'base'
2017-11-16 02:32:32,401 [salt.utils.extmods][INFO    ][22536] Loading cache from salt://_log_handlers, for base)
2017-11-16 02:32:32,401 [salt.fileclient  ][INFO    ][22536] Caching directory '_log_handlers/' for environment 'base'
2017-11-16 02:32:32,434 [salt.utils.extmods][INFO    ][22536] Creating module dir '/var/cache/salt/minion/extmods/proxy'
2017-11-16 02:32:32,437 [salt.utils.extmods][INFO    ][22536] Syncing proxy for environment 'base'
2017-11-16 02:32:32,437 [salt.utils.extmods][INFO    ][22536] Loading cache from salt://_proxy, for base)
2017-11-16 02:32:32,437 [salt.fileclient  ][INFO    ][22536] Caching directory '_proxy/' for environment 'base'
2017-11-16 02:32:32,468 [salt.utils.extmods][INFO    ][22536] Creating module dir '/var/cache/salt/minion/extmods/engines'
2017-11-16 02:32:32,470 [salt.utils.extmods][INFO    ][22536] Syncing engines for environment 'base'
2017-11-16 02:32:32,471 [salt.utils.extmods][INFO    ][22536] Loading cache from salt://_engines, for base)
2017-11-16 02:32:32,471 [salt.fileclient  ][INFO    ][22536] Caching directory '_engines/' for environment 'base'
2017-11-16 02:32:32,507 [salt.minion      ][INFO    ][22536] Returning information for job: 20171116023228972780
2017-11-16 02:32:38,062 [salt.minion      ][INFO    ][22407] User sudo_ubuntu Executing command state.sls with jid 20171116023238065991
2017-11-16 02:32:38,078 [salt.minion      ][INFO    ][22658] Starting a new job with PID 22658
2017-11-16 02:32:38,556 [salt.state       ][INFO    ][22658] Loading fresh modules for state activity
2017-11-16 02:32:38,580 [salt.fileclient  ][INFO    ][22658] Fetching file from saltenv 'base', ** done ** 'salt/control/init.sls'
2017-11-16 02:32:38,602 [salt.fileclient  ][INFO    ][22658] Fetching file from saltenv 'base', ** done ** 'salt/control/virt.sls'
2017-11-16 02:32:38,625 [salt.fileclient  ][INFO    ][22658] Fetching file from saltenv 'base', ** done ** 'salt/map.jinja'
2017-11-16 02:32:38,772 [salt.fileclient  ][INFO    ][22658] Fetching file from saltenv 'base', ** done ** 'salt/minion/init.sls'
2017-11-16 02:32:38,788 [salt.fileclient  ][INFO    ][22658] Fetching file from saltenv 'base', ** done ** 'salt/minion/service.sls'
2017-11-16 02:32:38,823 [salt.fileclient  ][INFO    ][22658] Fetching file from saltenv 'base', ** done ** 'salt/map.jinja'
2017-11-16 02:32:38,884 [salt.fileclient  ][INFO    ][22658] Fetching file from saltenv 'base', ** done ** 'linux/meta/salt.yml'
2017-11-16 02:32:38,901 [salt.fileclient  ][INFO    ][22658] Fetching file from saltenv 'base', ** done ** 'linux/map.jinja'
2017-11-16 02:32:38,945 [salt.fileclient  ][INFO    ][22658] Fetching file from saltenv 'base', ** done ** 'linux/meta/sphinx.yml'
2017-11-16 02:32:38,962 [salt.fileclient  ][INFO    ][22658] Fetching file from saltenv 'base', ** done ** 'keepalived/meta/sphinx.yml'
2017-11-16 02:32:38,974 [salt.fileclient  ][INFO    ][22658] Fetching file from saltenv 'base', ** done ** 'keepalived/map.jinja'
2017-11-16 02:32:38,989 [salt.fileclient  ][INFO    ][22658] Fetching file from saltenv 'base', ** done ** 'glusterfs/meta/sphinx.yml'
2017-11-16 02:32:38,997 [salt.loaded.int.module.cmdmod][INFO    ][22658] Executing command 'gluster --version 2>/dev/null || echo "unknown" |head -1' in directory '/root'
2017-11-16 02:32:39,049 [salt.fileclient  ][INFO    ][22658] Fetching file from saltenv 'base', ** done ** 'salt/meta/sphinx.yml'
2017-11-16 02:32:39,065 [py.warnings      ][WARNING ][22658] /usr/lib/python2.7/dist-packages/salt/utils/templates.py:73: DeprecationWarning: Starting in 2015.5, cmd.run uses python_shell=False by default, which doesn't support shellisms (pipes, env variables, etc). cmd.run is currently aliased to cmd.shell to prevent breakage. Please switch to cmd.shell or set python_shell=True to avoid breakage in the future, when this aliasing is removed.

2017-11-16 02:32:39,065 [salt.loaded.int.module.cmdmod][INFO    ][22658] Executing command 'salt-minion --version' in directory '/root'
2017-11-16 02:32:39,319 [salt.fileclient  ][INFO    ][22658] Fetching file from saltenv 'base', ** done ** 'keepalived/meta/salt.yml'
2017-11-16 02:32:39,338 [salt.fileclient  ][INFO    ][22658] Fetching file from saltenv 'base', ** done ** 'glusterfs/meta/salt.yml'
2017-11-16 02:32:39,349 [salt.fileclient  ][INFO    ][22658] Fetching file from saltenv 'base', ** done ** 'openssh/meta/salt.yml'
2017-11-16 02:32:39,361 [salt.fileclient  ][INFO    ][22658] Fetching file from saltenv 'base', ** done ** 'salt/meta/salt.yml'
2017-11-16 02:32:39,407 [salt.fileclient  ][INFO    ][22658] Fetching file from saltenv 'base', ** done ** 'linux/meta/meta.yml'
2017-11-16 02:32:39,471 [salt.fileclient  ][INFO    ][22658] Fetching file from saltenv 'base', ** done ** 'salt/meta/meta.yml'
2017-11-16 02:32:39,549 [salt.fileclient  ][INFO    ][22658] Fetching file from saltenv 'base', ** done ** 'salt/minion/grains.sls'
2017-11-16 02:32:39,600 [salt.fileclient  ][INFO    ][22658] Fetching file from saltenv 'base', ** done ** 'salt/map.jinja'
2017-11-16 02:32:39,678 [salt.fileclient  ][INFO    ][22658] Fetching file from saltenv 'base', ** done ** 'linux/meta/salt.yml'
2017-11-16 02:32:39,695 [salt.fileclient  ][INFO    ][22658] Fetching file from saltenv 'base', ** done ** 'linux/map.jinja'
2017-11-16 02:32:39,759 [salt.fileclient  ][INFO    ][22658] Fetching file from saltenv 'base', ** done ** 'linux/meta/sphinx.yml'
2017-11-16 02:32:39,777 [salt.fileclient  ][INFO    ][22658] Fetching file from saltenv 'base', ** done ** 'keepalived/meta/sphinx.yml'
2017-11-16 02:32:39,789 [salt.fileclient  ][INFO    ][22658] Fetching file from saltenv 'base', ** done ** 'keepalived/map.jinja'
2017-11-16 02:32:39,802 [salt.fileclient  ][INFO    ][22658] Fetching file from saltenv 'base', ** done ** 'glusterfs/meta/sphinx.yml'
2017-11-16 02:32:39,808 [salt.loaded.int.module.cmdmod][INFO    ][22658] Executing command 'gluster --version 2>/dev/null || echo "unknown" |head -1' in directory '/root'
2017-11-16 02:32:39,864 [salt.fileclient  ][INFO    ][22658] Fetching file from saltenv 'base', ** done ** 'salt/meta/sphinx.yml'
2017-11-16 02:32:39,879 [salt.loaded.int.module.cmdmod][INFO    ][22658] Executing command 'salt-minion --version' in directory '/root'
2017-11-16 02:32:40,137 [salt.fileclient  ][INFO    ][22658] Fetching file from saltenv 'base', ** done ** 'keepalived/meta/salt.yml'
2017-11-16 02:32:40,155 [salt.fileclient  ][INFO    ][22658] Fetching file from saltenv 'base', ** done ** 'glusterfs/meta/salt.yml'
2017-11-16 02:32:40,166 [salt.fileclient  ][INFO    ][22658] Fetching file from saltenv 'base', ** done ** 'openssh/meta/salt.yml'
2017-11-16 02:32:40,198 [salt.fileclient  ][INFO    ][22658] Fetching file from saltenv 'base', ** done ** 'salt/meta/salt.yml'
2017-11-16 02:32:40,264 [salt.fileclient  ][INFO    ][22658] Fetching file from saltenv 'base', ** done ** 'linux/meta/meta.yml'
2017-11-16 02:32:40,315 [salt.fileclient  ][INFO    ][22658] Fetching file from saltenv 'base', ** done ** 'salt/meta/meta.yml'
2017-11-16 02:32:40,390 [salt.fileclient  ][INFO    ][22658] Fetching file from saltenv 'base', ** done ** 'salt/minion/cert.sls'
2017-11-16 02:32:40,446 [salt.fileclient  ][INFO    ][22658] Fetching file from saltenv 'base', ** done ** 'salt/map.jinja'
2017-11-16 02:32:40,778 [salt.state       ][INFO    ][22658] Running state [salt-minion] at time 02:32:40.778116
2017-11-16 02:32:40,778 [salt.state       ][INFO    ][22658] Executing state pkg.installed for salt-minion
2017-11-16 02:32:40,779 [salt.loaded.int.module.cmdmod][INFO    ][22658] Executing command ['dpkg-query', '--showformat', '${Status} ${Package} ${Version} ${Architecture}\n', '-W'] in directory '/root'
2017-11-16 02:32:41,033 [salt.state       ][INFO    ][22658] Package salt-minion is already installed
2017-11-16 02:32:41,033 [salt.state       ][INFO    ][22658] Completed state [salt-minion] at time 02:32:41.033182 duration_in_ms=255.067
2017-11-16 02:32:41,033 [salt.state       ][INFO    ][22658] Running state [salt_minion_dependency_packages] at time 02:32:41.033392
2017-11-16 02:32:41,034 [salt.state       ][INFO    ][22658] Executing state pkg.installed for salt_minion_dependency_packages
2017-11-16 02:32:41,036 [salt.state       ][INFO    ][22658] All specified packages are already installed
2017-11-16 02:32:41,036 [salt.state       ][INFO    ][22658] Completed state [salt_minion_dependency_packages] at time 02:32:41.036439 duration_in_ms=3.047
2017-11-16 02:32:41,038 [salt.state       ][INFO    ][22658] Running state [/etc/salt/minion.d/minion.conf] at time 02:32:41.037985
2017-11-16 02:32:41,038 [salt.state       ][INFO    ][22658] Executing state file.managed for /etc/salt/minion.d/minion.conf
2017-11-16 02:32:41,058 [salt.fileclient  ][INFO    ][22658] Fetching file from saltenv 'base', ** done ** 'salt/files/minion.conf'
2017-11-16 02:32:41,103 [salt.fileclient  ][INFO    ][22658] Fetching file from saltenv 'base', ** done ** 'salt/map.jinja'
2017-11-16 02:32:41,145 [salt.fileclient  ][INFO    ][22658] Fetching file from saltenv 'base', ** done ** 'linux/map.jinja'
2017-11-16 02:32:41,178 [salt.state       ][INFO    ][22658] File /etc/salt/minion.d/minion.conf is in the correct state
2017-11-16 02:32:41,178 [salt.state       ][INFO    ][22658] Completed state [/etc/salt/minion.d/minion.conf] at time 02:32:41.177911 duration_in_ms=139.926
2017-11-16 02:32:41,178 [salt.state       ][INFO    ][22658] Running state [/etc/salt/minion.d/_virt.conf] at time 02:32:41.178196
2017-11-16 02:32:41,178 [salt.state       ][INFO    ][22658] Executing state file.managed for /etc/salt/minion.d/_virt.conf
2017-11-16 02:32:41,226 [salt.state       ][INFO    ][22658] File /etc/salt/minion.d/_virt.conf is in the correct state
2017-11-16 02:32:41,226 [salt.state       ][INFO    ][22658] Completed state [/etc/salt/minion.d/_virt.conf] at time 02:32:41.226030 duration_in_ms=47.834
2017-11-16 02:32:41,227 [salt.state       ][INFO    ][22658] Running state [salt-minion] at time 02:32:41.227411
2017-11-16 02:32:41,228 [salt.state       ][INFO    ][22658] Executing state service.running for salt-minion
2017-11-16 02:32:41,228 [salt.loaded.int.module.cmdmod][INFO    ][22658] Executing command ['systemctl', 'status', 'salt-minion.service', '-n', '0'] in directory '/root'
2017-11-16 02:32:41,247 [salt.loaded.int.module.cmdmod][INFO    ][22658] Executing command ['systemctl', 'is-active', 'salt-minion.service'] in directory '/root'
2017-11-16 02:32:41,275 [salt.loaded.int.module.cmdmod][INFO    ][22658] Executing command ['systemctl', 'is-enabled', 'salt-minion.service'] in directory '/root'
2017-11-16 02:32:41,284 [salt.state       ][INFO    ][22658] The service salt-minion is already running
2017-11-16 02:32:41,284 [salt.state       ][INFO    ][22658] Completed state [salt-minion] at time 02:32:41.283991 duration_in_ms=56.579
2017-11-16 02:32:41,285 [salt.state       ][INFO    ][22658] Running state [/etc/salt/grains.d] at time 02:32:41.285325
2017-11-16 02:32:41,286 [salt.state       ][INFO    ][22658] Executing state file.directory for /etc/salt/grains.d
2017-11-16 02:32:41,286 [salt.state       ][INFO    ][22658] Directory /etc/salt/grains.d is in the correct state
2017-11-16 02:32:41,286 [salt.state       ][INFO    ][22658] Completed state [/etc/salt/grains.d] at time 02:32:41.286264 duration_in_ms=0.939
2017-11-16 02:32:41,287 [salt.state       ][INFO    ][22658] Running state [/etc/salt/grains] at time 02:32:41.286680
2017-11-16 02:32:41,287 [salt.state       ][INFO    ][22658] Executing state file.managed for /etc/salt/grains
2017-11-16 02:32:41,287 [salt.state       ][INFO    ][22658] File /etc/salt/grains exists with proper permissions. No changes made.
2017-11-16 02:32:41,287 [salt.state       ][INFO    ][22658] Completed state [/etc/salt/grains] at time 02:32:41.287349 duration_in_ms=0.669
2017-11-16 02:32:41,288 [salt.state       ][INFO    ][22658] Running state [/etc/salt/grains.d/placeholder] at time 02:32:41.287657
2017-11-16 02:32:41,288 [salt.state       ][INFO    ][22658] Executing state file.managed for /etc/salt/grains.d/placeholder
2017-11-16 02:32:41,288 [salt.state       ][INFO    ][22658] File /etc/salt/grains.d/placeholder exists with proper permissions. No changes made.
2017-11-16 02:32:41,288 [salt.state       ][INFO    ][22658] Completed state [/etc/salt/grains.d/placeholder] at time 02:32:41.288315 duration_in_ms=0.657
2017-11-16 02:32:41,289 [salt.state       ][INFO    ][22658] Running state [/etc/salt/grains.d/sphinx] at time 02:32:41.288601
2017-11-16 02:32:41,289 [salt.state       ][INFO    ][22658] Executing state file.managed for /etc/salt/grains.d/sphinx
2017-11-16 02:32:41,310 [salt.state       ][INFO    ][22658] File changed:
--- 
+++ 
@@ -49,7 +49,6 @@
               - 10.167.4.142
               - 127.0.0.1
               - 192.168.11.254
-              - 192.168.122.1
         system:
           name: System
           param:

2017-11-16 02:32:41,311 [salt.state       ][INFO    ][22658] Completed state [/etc/salt/grains.d/sphinx] at time 02:32:41.310564 duration_in_ms=21.963
2017-11-16 02:32:41,311 [salt.state       ][INFO    ][22658] Running state [python -c "import yaml; stream = file('/etc/salt/grains.d/sphinx', 'r'); yaml.load(stream); stream.close()"] at time 02:32:41.311135
2017-11-16 02:32:41,311 [salt.state       ][INFO    ][22658] Executing state cmd.wait for python -c "import yaml; stream = file('/etc/salt/grains.d/sphinx', 'r'); yaml.load(stream); stream.close()"
2017-11-16 02:32:41,312 [salt.state       ][INFO    ][22658] No changes made for python -c "import yaml; stream = file('/etc/salt/grains.d/sphinx', 'r'); yaml.load(stream); stream.close()"
2017-11-16 02:32:41,312 [salt.state       ][INFO    ][22658] Completed state [python -c "import yaml; stream = file('/etc/salt/grains.d/sphinx', 'r'); yaml.load(stream); stream.close()"] at time 02:32:41.311736 duration_in_ms=0.601
2017-11-16 02:32:41,312 [salt.state       ][INFO    ][22658] Running state [python -c "import yaml; stream = file('/etc/salt/grains.d/sphinx', 'r'); yaml.load(stream); stream.close()"] at time 02:32:41.311904
2017-11-16 02:32:41,312 [salt.state       ][INFO    ][22658] Executing state cmd.mod_watch for python -c "import yaml; stream = file('/etc/salt/grains.d/sphinx', 'r'); yaml.load(stream); stream.close()"
2017-11-16 02:32:41,313 [salt.loaded.int.module.cmdmod][INFO    ][22658] Executing command 'python -c "import yaml; stream = file('/etc/salt/grains.d/sphinx', 'r'); yaml.load(stream); stream.close()"' in directory '/root'
2017-11-16 02:32:41,393 [salt.state       ][INFO    ][22658] {'pid': 22706, 'retcode': 0, 'stderr': '', 'stdout': ''}
2017-11-16 02:32:41,393 [salt.state       ][INFO    ][22658] Completed state [python -c "import yaml; stream = file('/etc/salt/grains.d/sphinx', 'r'); yaml.load(stream); stream.close()"] at time 02:32:41.392939 duration_in_ms=81.035
2017-11-16 02:32:41,393 [salt.state       ][INFO    ][22658] Running state [/etc/salt/grains.d/dns_records] at time 02:32:41.393396
2017-11-16 02:32:41,394 [salt.state       ][INFO    ][22658] Executing state file.managed for /etc/salt/grains.d/dns_records
2017-11-16 02:32:41,427 [salt.state       ][INFO    ][22658] File /etc/salt/grains.d/dns_records is in the correct state
2017-11-16 02:32:41,427 [salt.state       ][INFO    ][22658] Completed state [/etc/salt/grains.d/dns_records] at time 02:32:41.426888 duration_in_ms=33.492
2017-11-16 02:32:41,428 [salt.state       ][INFO    ][22658] Running state [python -c "import yaml; stream = file('/etc/salt/grains.d/dns_records', 'r'); yaml.load(stream); stream.close()"] at time 02:32:41.427572
2017-11-16 02:32:41,428 [salt.state       ][INFO    ][22658] Executing state cmd.wait for python -c "import yaml; stream = file('/etc/salt/grains.d/dns_records', 'r'); yaml.load(stream); stream.close()"
2017-11-16 02:32:41,428 [salt.state       ][INFO    ][22658] No changes made for python -c "import yaml; stream = file('/etc/salt/grains.d/dns_records', 'r'); yaml.load(stream); stream.close()"
2017-11-16 02:32:41,428 [salt.state       ][INFO    ][22658] Completed state [python -c "import yaml; stream = file('/etc/salt/grains.d/dns_records', 'r'); yaml.load(stream); stream.close()"] at time 02:32:41.428064 duration_in_ms=0.492
2017-11-16 02:32:41,428 [salt.state       ][INFO    ][22658] Running state [/etc/salt/grains.d/salt] at time 02:32:41.428323
2017-11-16 02:32:41,428 [salt.state       ][INFO    ][22658] Executing state file.managed for /etc/salt/grains.d/salt
2017-11-16 02:32:41,470 [salt.state       ][INFO    ][22658] File /etc/salt/grains.d/salt is in the correct state
2017-11-16 02:32:41,470 [salt.state       ][INFO    ][22658] Completed state [/etc/salt/grains.d/salt] at time 02:32:41.470111 duration_in_ms=41.788
2017-11-16 02:32:41,471 [salt.state       ][INFO    ][22658] Running state [python -c "import yaml; stream = file('/etc/salt/grains.d/salt', 'r'); yaml.load(stream); stream.close()"] at time 02:32:41.470642
2017-11-16 02:32:41,471 [salt.state       ][INFO    ][22658] Executing state cmd.wait for python -c "import yaml; stream = file('/etc/salt/grains.d/salt', 'r'); yaml.load(stream); stream.close()"
2017-11-16 02:32:41,471 [salt.state       ][INFO    ][22658] No changes made for python -c "import yaml; stream = file('/etc/salt/grains.d/salt', 'r'); yaml.load(stream); stream.close()"
2017-11-16 02:32:41,471 [salt.state       ][INFO    ][22658] Completed state [python -c "import yaml; stream = file('/etc/salt/grains.d/salt', 'r'); yaml.load(stream); stream.close()"] at time 02:32:41.471135 duration_in_ms=0.493
2017-11-16 02:32:41,472 [salt.state       ][INFO    ][22658] Running state [cat /etc/salt/grains.d/* > /etc/salt/grains] at time 02:32:41.472326
2017-11-16 02:32:41,473 [salt.state       ][INFO    ][22658] Executing state cmd.wait for cat /etc/salt/grains.d/* > /etc/salt/grains
2017-11-16 02:32:41,473 [salt.state       ][INFO    ][22658] No changes made for cat /etc/salt/grains.d/* > /etc/salt/grains
2017-11-16 02:32:41,473 [salt.state       ][INFO    ][22658] Completed state [cat /etc/salt/grains.d/* > /etc/salt/grains] at time 02:32:41.472832 duration_in_ms=0.507
2017-11-16 02:32:41,473 [salt.state       ][INFO    ][22658] Running state [cat /etc/salt/grains.d/* > /etc/salt/grains] at time 02:32:41.472957
2017-11-16 02:32:41,473 [salt.state       ][INFO    ][22658] Executing state cmd.mod_watch for cat /etc/salt/grains.d/* > /etc/salt/grains
2017-11-16 02:32:41,475 [salt.loaded.int.module.cmdmod][INFO    ][22658] Executing command 'cat /etc/salt/grains.d/* > /etc/salt/grains' in directory '/root'
2017-11-16 02:32:41,484 [salt.state       ][INFO    ][22658] {'pid': 22708, 'retcode': 0, 'stderr': '', 'stdout': ''}
2017-11-16 02:32:41,484 [salt.state       ][INFO    ][22658] Completed state [cat /etc/salt/grains.d/* > /etc/salt/grains] at time 02:32:41.484344 duration_in_ms=11.386
2017-11-16 02:32:41,485 [salt.state       ][INFO    ][22658] Running state [mine.update] at time 02:32:41.484994
2017-11-16 02:32:41,485 [salt.state       ][INFO    ][22658] Executing state module.wait for mine.update
2017-11-16 02:32:41,486 [salt.state       ][INFO    ][22658] No changes made for mine.update
2017-11-16 02:32:41,486 [salt.state       ][INFO    ][22658] Completed state [mine.update] at time 02:32:41.485684 duration_in_ms=0.69
2017-11-16 02:32:41,486 [salt.state       ][INFO    ][22658] Running state [mine.update] at time 02:32:41.485873
2017-11-16 02:32:41,486 [salt.state       ][INFO    ][22658] Executing state module.mod_watch for mine.update
2017-11-16 02:32:42,008 [salt.state       ][INFO    ][22658] {'ret': True}
2017-11-16 02:32:42,008 [salt.state       ][INFO    ][22658] Completed state [mine.update] at time 02:32:42.008297 duration_in_ms=522.423
2017-11-16 02:32:42,009 [salt.state       ][INFO    ][22658] Running state [ca-certificates] at time 02:32:42.008672
2017-11-16 02:32:42,009 [salt.state       ][INFO    ][22658] Executing state pkg.installed for ca-certificates
2017-11-16 02:32:42,012 [salt.state       ][INFO    ][22658] Package ca-certificates is already installed
2017-11-16 02:32:42,013 [salt.state       ][INFO    ][22658] Completed state [ca-certificates] at time 02:32:42.012536 duration_in_ms=3.864
2017-11-16 02:32:42,013 [salt.state       ][INFO    ][22658] Running state [update-ca-certificates] at time 02:32:42.013201
2017-11-16 02:32:42,014 [salt.state       ][INFO    ][22658] Executing state cmd.wait for update-ca-certificates
2017-11-16 02:32:42,014 [salt.state       ][INFO    ][22658] No changes made for update-ca-certificates
2017-11-16 02:32:42,014 [salt.state       ][INFO    ][22658] Completed state [update-ca-certificates] at time 02:32:42.014033 duration_in_ms=0.831
2017-11-16 02:32:42,014 [salt.state       ][INFO    ][22658] Running state [libvirt-dev] at time 02:32:42.014309
2017-11-16 02:32:42,015 [salt.state       ][INFO    ][22658] Executing state pkg.installed for libvirt-dev
2017-11-16 02:32:42,017 [salt.state       ][INFO    ][22658] Package libvirt-dev is already installed
2017-11-16 02:32:42,023 [salt.state       ][INFO    ][22658] Completed state [libvirt-dev] at time 02:32:42.022682 duration_in_ms=8.372
2017-11-16 02:32:42,023 [salt.state       ][INFO    ][22658] Running state [pkg-config] at time 02:32:42.023177
2017-11-16 02:32:42,023 [salt.state       ][INFO    ][22658] Executing state pkg.installed for pkg-config
2017-11-16 02:32:42,026 [salt.state       ][INFO    ][22658] Package pkg-config is already installed
2017-11-16 02:32:42,027 [salt.state       ][INFO    ][22658] Completed state [pkg-config] at time 02:32:42.026598 duration_in_ms=3.421
2017-11-16 02:32:42,027 [salt.state       ][INFO    ][22658] Running state [virtng.init] at time 02:32:42.026871
2017-11-16 02:32:42,027 [salt.state       ][INFO    ][22658] Executing state module.run for virtng.init
2017-11-16 02:32:42,082 [salt.loaded.int.module.cmdmod][INFO    ][22658] Executing command ['git', '--version'] in directory '/root'
2017-11-16 02:32:42,197 [salt.loaded.int.module.cmdmod][INFO    ][22658] Executing command 'virsh list --all --name| grep -E "^mdb02.baremetal-mcp-ocata-ovs-ha.local$"' in directory '/root'
2017-11-16 02:32:42,217 [salt.state       ][INFO    ][22658] unless execution succeeded
2017-11-16 02:32:42,217 [salt.state       ][INFO    ][22658] Completed state [virtng.init] at time 02:32:42.217242 duration_in_ms=190.37
2017-11-16 02:32:42,218 [salt.state       ][INFO    ][22658] Running state [virt.set_autostart] at time 02:32:42.217499
2017-11-16 02:32:42,218 [salt.state       ][INFO    ][22658] Executing state module.run for virt.set_autostart
2017-11-16 02:32:42,220 [salt.loaded.int.module.cmdmod][INFO    ][22658] Executing command 'virsh list --autostart --name| grep -E "^mdb02.baremetal-mcp-ocata-ovs-ha.local$"' in directory '/root'
2017-11-16 02:32:42,239 [salt.state       ][INFO    ][22658] unless execution succeeded
2017-11-16 02:32:42,239 [salt.state       ][INFO    ][22658] Completed state [virt.set_autostart] at time 02:32:42.238987 duration_in_ms=21.488
2017-11-16 02:32:42,239 [salt.state       ][INFO    ][22658] Running state [virtng.init] at time 02:32:42.239229
2017-11-16 02:32:42,239 [salt.state       ][INFO    ][22658] Executing state module.run for virtng.init
2017-11-16 02:32:42,241 [salt.loaded.int.module.cmdmod][INFO    ][22658] Executing command 'virsh list --all --name| grep -E "^dbs02.baremetal-mcp-ocata-ovs-ha.local$"' in directory '/root'
2017-11-16 02:32:42,258 [salt.state       ][INFO    ][22658] unless execution succeeded
2017-11-16 02:32:42,258 [salt.state       ][INFO    ][22658] Completed state [virtng.init] at time 02:32:42.258098 duration_in_ms=18.868
2017-11-16 02:32:42,258 [salt.state       ][INFO    ][22658] Running state [virt.set_autostart] at time 02:32:42.258333
2017-11-16 02:32:42,259 [salt.state       ][INFO    ][22658] Executing state module.run for virt.set_autostart
2017-11-16 02:32:42,261 [salt.loaded.int.module.cmdmod][INFO    ][22658] Executing command 'virsh list --autostart --name| grep -E "^dbs02.baremetal-mcp-ocata-ovs-ha.local$"' in directory '/root'
2017-11-16 02:32:42,292 [salt.state       ][INFO    ][22658] unless execution succeeded
2017-11-16 02:32:42,305 [salt.state       ][INFO    ][22658] Completed state [virt.set_autostart] at time 02:32:42.304899 duration_in_ms=46.564
2017-11-16 02:32:42,305 [salt.state       ][INFO    ][22658] Running state [virtng.init] at time 02:32:42.305206
2017-11-16 02:32:42,305 [salt.state       ][INFO    ][22658] Executing state module.run for virtng.init
2017-11-16 02:32:42,307 [salt.loaded.int.module.cmdmod][INFO    ][22658] Executing command 'virsh list --all --name| grep -E "^ctl02.baremetal-mcp-ocata-ovs-ha.local$"' in directory '/root'
2017-11-16 02:32:42,329 [salt.state       ][INFO    ][22658] unless execution succeeded
2017-11-16 02:32:42,329 [salt.state       ][INFO    ][22658] Completed state [virtng.init] at time 02:32:42.329295 duration_in_ms=24.087
2017-11-16 02:32:42,330 [salt.state       ][INFO    ][22658] Running state [virt.set_autostart] at time 02:32:42.329585
2017-11-16 02:32:42,330 [salt.state       ][INFO    ][22658] Executing state module.run for virt.set_autostart
2017-11-16 02:32:42,332 [salt.loaded.int.module.cmdmod][INFO    ][22658] Executing command 'virsh list --autostart --name| grep -E "^ctl02.baremetal-mcp-ocata-ovs-ha.local$"' in directory '/root'
2017-11-16 02:32:42,347 [salt.state       ][INFO    ][22658] unless execution succeeded
2017-11-16 02:32:42,349 [salt.state       ][INFO    ][22658] Completed state [virt.set_autostart] at time 02:32:42.348977 duration_in_ms=19.392
2017-11-16 02:32:42,349 [salt.state       ][INFO    ][22658] Running state [virtng.init] at time 02:32:42.349285
2017-11-16 02:32:42,350 [salt.state       ][INFO    ][22658] Executing state module.run for virtng.init
2017-11-16 02:32:42,352 [salt.loaded.int.module.cmdmod][INFO    ][22658] Executing command 'virsh list --all --name| grep -E "^msg02.baremetal-mcp-ocata-ovs-ha.local$"' in directory '/root'
2017-11-16 02:32:42,366 [salt.state       ][INFO    ][22658] unless execution succeeded
2017-11-16 02:32:42,367 [salt.state       ][INFO    ][22658] Completed state [virtng.init] at time 02:32:42.366550 duration_in_ms=17.265
2017-11-16 02:32:42,367 [salt.state       ][INFO    ][22658] Running state [virt.set_autostart] at time 02:32:42.366841
2017-11-16 02:32:42,367 [salt.state       ][INFO    ][22658] Executing state module.run for virt.set_autostart
2017-11-16 02:32:42,369 [salt.loaded.int.module.cmdmod][INFO    ][22658] Executing command 'virsh list --autostart --name| grep -E "^msg02.baremetal-mcp-ocata-ovs-ha.local$"' in directory '/root'
2017-11-16 02:32:42,383 [salt.state       ][INFO    ][22658] unless execution succeeded
2017-11-16 02:32:42,384 [salt.state       ][INFO    ][22658] Completed state [virt.set_autostart] at time 02:32:42.383662 duration_in_ms=16.821
2017-11-16 02:32:42,407 [salt.minion      ][INFO    ][22658] Returning information for job: 20171116023238065991
2017-11-16 02:33:09,126 [salt.minion      ][INFO    ][22407] User sudo_ubuntu Executing command state.sls with jid 20171116023309124553
2017-11-16 02:33:09,140 [salt.minion      ][INFO    ][22755] Starting a new job with PID 22755
2017-11-16 02:33:10,632 [salt.state       ][INFO    ][22755] Loading fresh modules for state activity
2017-11-16 02:33:10,771 [salt.fileclient  ][INFO    ][22755] Fetching file from saltenv 'base', ** done ** 'salt/control/init.sls'
2017-11-16 02:33:10,792 [salt.fileclient  ][INFO    ][22755] Fetching file from saltenv 'base', ** done ** 'salt/control/virt.sls'
2017-11-16 02:33:10,818 [salt.fileclient  ][INFO    ][22755] Fetching file from saltenv 'base', ** done ** 'salt/map.jinja'
2017-11-16 02:33:10,938 [salt.fileclient  ][INFO    ][22755] Fetching file from saltenv 'base', ** done ** 'salt/minion/init.sls'
2017-11-16 02:33:10,955 [salt.fileclient  ][INFO    ][22755] Fetching file from saltenv 'base', ** done ** 'salt/minion/service.sls'
2017-11-16 02:33:10,982 [salt.fileclient  ][INFO    ][22755] Fetching file from saltenv 'base', ** done ** 'salt/map.jinja'
2017-11-16 02:33:11,039 [salt.fileclient  ][INFO    ][22755] Fetching file from saltenv 'base', ** done ** 'linux/meta/salt.yml'
2017-11-16 02:33:11,058 [salt.fileclient  ][INFO    ][22755] Fetching file from saltenv 'base', ** done ** 'linux/map.jinja'
2017-11-16 02:33:11,103 [salt.fileclient  ][INFO    ][22755] Fetching file from saltenv 'base', ** done ** 'linux/meta/sphinx.yml'
2017-11-16 02:33:11,122 [salt.fileclient  ][INFO    ][22755] Fetching file from saltenv 'base', ** done ** 'keepalived/meta/sphinx.yml'
2017-11-16 02:33:11,289 [salt.fileclient  ][INFO    ][22755] Fetching file from saltenv 'base', ** done ** 'keepalived/map.jinja'
2017-11-16 02:33:11,306 [salt.fileclient  ][INFO    ][22755] Fetching file from saltenv 'base', ** done ** 'glusterfs/meta/sphinx.yml'
2017-11-16 02:33:11,314 [salt.loaded.int.module.cmdmod][INFO    ][22755] Executing command 'gluster --version 2>/dev/null || echo "unknown" |head -1' in directory '/root'
2017-11-16 02:33:11,336 [salt.fileclient  ][INFO    ][22755] Fetching file from saltenv 'base', ** done ** 'salt/meta/sphinx.yml'
2017-11-16 02:33:11,350 [py.warnings      ][WARNING ][22755] /usr/lib/python2.7/dist-packages/salt/utils/templates.py:73: DeprecationWarning: Starting in 2015.5, cmd.run uses python_shell=False by default, which doesn't support shellisms (pipes, env variables, etc). cmd.run is currently aliased to cmd.shell to prevent breakage. Please switch to cmd.shell or set python_shell=True to avoid breakage in the future, when this aliasing is removed.

2017-11-16 02:33:11,351 [salt.loaded.int.module.cmdmod][INFO    ][22755] Executing command 'salt-minion --version' in directory '/root'
2017-11-16 02:33:11,606 [salt.fileclient  ][INFO    ][22755] Fetching file from saltenv 'base', ** done ** 'keepalived/meta/salt.yml'
2017-11-16 02:33:11,731 [salt.fileclient  ][INFO    ][22755] Fetching file from saltenv 'base', ** done ** 'glusterfs/meta/salt.yml'
2017-11-16 02:33:11,745 [salt.fileclient  ][INFO    ][22755] Fetching file from saltenv 'base', ** done ** 'openssh/meta/salt.yml'
2017-11-16 02:33:11,758 [salt.fileclient  ][INFO    ][22755] Fetching file from saltenv 'base', ** done ** 'salt/meta/salt.yml'
2017-11-16 02:33:11,967 [salt.fileclient  ][INFO    ][22755] Fetching file from saltenv 'base', ** done ** 'linux/meta/meta.yml'
2017-11-16 02:33:12,054 [salt.fileclient  ][INFO    ][22755] Fetching file from saltenv 'base', ** done ** 'salt/meta/meta.yml'
2017-11-16 02:33:12,108 [salt.fileclient  ][INFO    ][22755] Fetching file from saltenv 'base', ** done ** 'salt/minion/grains.sls'
2017-11-16 02:33:12,127 [salt.fileclient  ][INFO    ][22755] Fetching file from saltenv 'base', ** done ** 'salt/map.jinja'
2017-11-16 02:33:12,181 [salt.fileclient  ][INFO    ][22755] Fetching file from saltenv 'base', ** done ** 'linux/meta/salt.yml'
2017-11-16 02:33:12,199 [salt.fileclient  ][INFO    ][22755] Fetching file from saltenv 'base', ** done ** 'linux/map.jinja'
2017-11-16 02:33:12,242 [salt.fileclient  ][INFO    ][22755] Fetching file from saltenv 'base', ** done ** 'linux/meta/sphinx.yml'
2017-11-16 02:33:12,260 [salt.fileclient  ][INFO    ][22755] Fetching file from saltenv 'base', ** done ** 'keepalived/meta/sphinx.yml'
2017-11-16 02:33:12,272 [salt.fileclient  ][INFO    ][22755] Fetching file from saltenv 'base', ** done ** 'keepalived/map.jinja'
2017-11-16 02:33:12,287 [salt.fileclient  ][INFO    ][22755] Fetching file from saltenv 'base', ** done ** 'glusterfs/meta/sphinx.yml'
2017-11-16 02:33:12,295 [salt.loaded.int.module.cmdmod][INFO    ][22755] Executing command 'gluster --version 2>/dev/null || echo "unknown" |head -1' in directory '/root'
2017-11-16 02:33:12,318 [salt.fileclient  ][INFO    ][22755] Fetching file from saltenv 'base', ** done ** 'salt/meta/sphinx.yml'
2017-11-16 02:33:12,333 [salt.loaded.int.module.cmdmod][INFO    ][22755] Executing command 'salt-minion --version' in directory '/root'
2017-11-16 02:33:12,585 [salt.fileclient  ][INFO    ][22755] Fetching file from saltenv 'base', ** done ** 'keepalived/meta/salt.yml'
2017-11-16 02:33:12,604 [salt.fileclient  ][INFO    ][22755] Fetching file from saltenv 'base', ** done ** 'glusterfs/meta/salt.yml'
2017-11-16 02:33:12,616 [salt.fileclient  ][INFO    ][22755] Fetching file from saltenv 'base', ** done ** 'openssh/meta/salt.yml'
2017-11-16 02:33:12,627 [salt.fileclient  ][INFO    ][22755] Fetching file from saltenv 'base', ** done ** 'salt/meta/salt.yml'
2017-11-16 02:33:12,672 [salt.fileclient  ][INFO    ][22755] Fetching file from saltenv 'base', ** done ** 'linux/meta/meta.yml'
2017-11-16 02:33:12,709 [salt.fileclient  ][INFO    ][22755] Fetching file from saltenv 'base', ** done ** 'salt/meta/meta.yml'
2017-11-16 02:33:12,772 [salt.fileclient  ][INFO    ][22755] Fetching file from saltenv 'base', ** done ** 'salt/minion/cert.sls'
2017-11-16 02:33:12,856 [salt.fileclient  ][INFO    ][22755] Fetching file from saltenv 'base', ** done ** 'salt/map.jinja'
2017-11-16 02:33:13,276 [salt.state       ][INFO    ][22755] Running state [salt-minion] at time 02:33:13.276140
2017-11-16 02:33:13,276 [salt.state       ][INFO    ][22755] Executing state pkg.installed for salt-minion
2017-11-16 02:33:13,277 [salt.loaded.int.module.cmdmod][INFO    ][22755] Executing command ['dpkg-query', '--showformat', '${Status} ${Package} ${Version} ${Architecture}\n', '-W'] in directory '/root'
2017-11-16 02:33:13,535 [salt.state       ][INFO    ][22755] Package salt-minion is already installed
2017-11-16 02:33:13,535 [salt.state       ][INFO    ][22755] Completed state [salt-minion] at time 02:33:13.534764 duration_in_ms=258.625
2017-11-16 02:33:13,535 [salt.state       ][INFO    ][22755] Running state [salt_minion_dependency_packages] at time 02:33:13.534980
2017-11-16 02:33:13,535 [salt.state       ][INFO    ][22755] Executing state pkg.installed for salt_minion_dependency_packages
2017-11-16 02:33:13,538 [salt.state       ][INFO    ][22755] All specified packages are already installed
2017-11-16 02:33:13,538 [salt.state       ][INFO    ][22755] Completed state [salt_minion_dependency_packages] at time 02:33:13.537952 duration_in_ms=2.972
2017-11-16 02:33:13,539 [salt.state       ][INFO    ][22755] Running state [/etc/salt/minion.d/minion.conf] at time 02:33:13.539394
2017-11-16 02:33:13,540 [salt.state       ][INFO    ][22755] Executing state file.managed for /etc/salt/minion.d/minion.conf
2017-11-16 02:33:13,557 [salt.fileclient  ][INFO    ][22755] Fetching file from saltenv 'base', ** done ** 'salt/files/minion.conf'
2017-11-16 02:33:13,601 [salt.fileclient  ][INFO    ][22755] Fetching file from saltenv 'base', ** done ** 'salt/map.jinja'
2017-11-16 02:33:13,642 [salt.fileclient  ][INFO    ][22755] Fetching file from saltenv 'base', ** done ** 'linux/map.jinja'
2017-11-16 02:33:13,675 [salt.state       ][INFO    ][22755] File /etc/salt/minion.d/minion.conf is in the correct state
2017-11-16 02:33:13,675 [salt.state       ][INFO    ][22755] Completed state [/etc/salt/minion.d/minion.conf] at time 02:33:13.675073 duration_in_ms=135.679
2017-11-16 02:33:13,675 [salt.state       ][INFO    ][22755] Running state [/etc/salt/minion.d/_virt.conf] at time 02:33:13.675346
2017-11-16 02:33:13,676 [salt.state       ][INFO    ][22755] Executing state file.managed for /etc/salt/minion.d/_virt.conf
2017-11-16 02:33:13,699 [salt.state       ][INFO    ][22755] File /etc/salt/minion.d/_virt.conf is in the correct state
2017-11-16 02:33:13,700 [salt.state       ][INFO    ][22755] Completed state [/etc/salt/minion.d/_virt.conf] at time 02:33:13.699477 duration_in_ms=24.13
2017-11-16 02:33:13,701 [salt.state       ][INFO    ][22755] Running state [salt-minion] at time 02:33:13.700787
2017-11-16 02:33:13,701 [salt.state       ][INFO    ][22755] Executing state service.running for salt-minion
2017-11-16 02:33:13,701 [salt.loaded.int.module.cmdmod][INFO    ][22755] Executing command ['systemctl', 'status', 'salt-minion.service', '-n', '0'] in directory '/root'
2017-11-16 02:33:13,729 [salt.loaded.int.module.cmdmod][INFO    ][22755] Executing command ['systemctl', 'is-active', 'salt-minion.service'] in directory '/root'
2017-11-16 02:33:13,738 [salt.loaded.int.module.cmdmod][INFO    ][22755] Executing command ['systemctl', 'is-enabled', 'salt-minion.service'] in directory '/root'
2017-11-16 02:33:13,746 [salt.state       ][INFO    ][22755] The service salt-minion is already running
2017-11-16 02:33:13,753 [salt.state       ][INFO    ][22755] Completed state [salt-minion] at time 02:33:13.752623 duration_in_ms=51.835
2017-11-16 02:33:13,754 [salt.state       ][INFO    ][22755] Running state [/etc/salt/grains.d] at time 02:33:13.753997
2017-11-16 02:33:13,754 [salt.state       ][INFO    ][22755] Executing state file.directory for /etc/salt/grains.d
2017-11-16 02:33:13,755 [salt.state       ][INFO    ][22755] Directory /etc/salt/grains.d is in the correct state
2017-11-16 02:33:13,755 [salt.state       ][INFO    ][22755] Completed state [/etc/salt/grains.d] at time 02:33:13.754858 duration_in_ms=0.861
2017-11-16 02:33:13,755 [salt.state       ][INFO    ][22755] Running state [/etc/salt/grains] at time 02:33:13.755267
2017-11-16 02:33:13,755 [salt.state       ][INFO    ][22755] Executing state file.managed for /etc/salt/grains
2017-11-16 02:33:13,756 [salt.state       ][INFO    ][22755] File /etc/salt/grains exists with proper permissions. No changes made.
2017-11-16 02:33:13,756 [salt.state       ][INFO    ][22755] Completed state [/etc/salt/grains] at time 02:33:13.755885 duration_in_ms=0.616
2017-11-16 02:33:13,756 [salt.state       ][INFO    ][22755] Running state [/etc/salt/grains.d/placeholder] at time 02:33:13.756145
2017-11-16 02:33:13,756 [salt.state       ][INFO    ][22755] Executing state file.managed for /etc/salt/grains.d/placeholder
2017-11-16 02:33:13,757 [salt.state       ][INFO    ][22755] File /etc/salt/grains.d/placeholder exists with proper permissions. No changes made.
2017-11-16 02:33:13,757 [salt.state       ][INFO    ][22755] Completed state [/etc/salt/grains.d/placeholder] at time 02:33:13.756759 duration_in_ms=0.613
2017-11-16 02:33:13,757 [salt.state       ][INFO    ][22755] Running state [/etc/salt/grains.d/sphinx] at time 02:33:13.757019
2017-11-16 02:33:13,757 [salt.state       ][INFO    ][22755] Executing state file.managed for /etc/salt/grains.d/sphinx
2017-11-16 02:33:13,772 [salt.state       ][INFO    ][22755] File /etc/salt/grains.d/sphinx is in the correct state
2017-11-16 02:33:13,772 [salt.state       ][INFO    ][22755] Completed state [/etc/salt/grains.d/sphinx] at time 02:33:13.771927 duration_in_ms=14.908
2017-11-16 02:33:13,772 [salt.state       ][INFO    ][22755] Running state [python -c "import yaml; stream = file('/etc/salt/grains.d/sphinx', 'r'); yaml.load(stream); stream.close()"] at time 02:33:13.772438
2017-11-16 02:33:13,773 [salt.state       ][INFO    ][22755] Executing state cmd.wait for python -c "import yaml; stream = file('/etc/salt/grains.d/sphinx', 'r'); yaml.load(stream); stream.close()"
2017-11-16 02:33:13,773 [salt.state       ][INFO    ][22755] No changes made for python -c "import yaml; stream = file('/etc/salt/grains.d/sphinx', 'r'); yaml.load(stream); stream.close()"
2017-11-16 02:33:13,773 [salt.state       ][INFO    ][22755] Completed state [python -c "import yaml; stream = file('/etc/salt/grains.d/sphinx', 'r'); yaml.load(stream); stream.close()"] at time 02:33:13.772899 duration_in_ms=0.461
2017-11-16 02:33:13,773 [salt.state       ][INFO    ][22755] Running state [/etc/salt/grains.d/dns_records] at time 02:33:13.773147
2017-11-16 02:33:13,773 [salt.state       ][INFO    ][22755] Executing state file.managed for /etc/salt/grains.d/dns_records
2017-11-16 02:33:13,806 [salt.state       ][INFO    ][22755] File /etc/salt/grains.d/dns_records is in the correct state
2017-11-16 02:33:13,806 [salt.state       ][INFO    ][22755] Completed state [/etc/salt/grains.d/dns_records] at time 02:33:13.806397 duration_in_ms=33.249
2017-11-16 02:33:13,807 [salt.state       ][INFO    ][22755] Running state [python -c "import yaml; stream = file('/etc/salt/grains.d/dns_records', 'r'); yaml.load(stream); stream.close()"] at time 02:33:13.807053
2017-11-16 02:33:13,807 [salt.state       ][INFO    ][22755] Executing state cmd.wait for python -c "import yaml; stream = file('/etc/salt/grains.d/dns_records', 'r'); yaml.load(stream); stream.close()"
2017-11-16 02:33:13,807 [salt.state       ][INFO    ][22755] No changes made for python -c "import yaml; stream = file('/etc/salt/grains.d/dns_records', 'r'); yaml.load(stream); stream.close()"
2017-11-16 02:33:13,808 [salt.state       ][INFO    ][22755] Completed state [python -c "import yaml; stream = file('/etc/salt/grains.d/dns_records', 'r'); yaml.load(stream); stream.close()"] at time 02:33:13.807616 duration_in_ms=0.563
2017-11-16 02:33:13,808 [salt.state       ][INFO    ][22755] Running state [/etc/salt/grains.d/salt] at time 02:33:13.807897
2017-11-16 02:33:13,808 [salt.state       ][INFO    ][22755] Executing state file.managed for /etc/salt/grains.d/salt
2017-11-16 02:33:13,814 [salt.state       ][INFO    ][22755] File /etc/salt/grains.d/salt is in the correct state
2017-11-16 02:33:13,814 [salt.state       ][INFO    ][22755] Completed state [/etc/salt/grains.d/salt] at time 02:33:13.813828 duration_in_ms=5.93
2017-11-16 02:33:13,815 [salt.state       ][INFO    ][22755] Running state [python -c "import yaml; stream = file('/etc/salt/grains.d/salt', 'r'); yaml.load(stream); stream.close()"] at time 02:33:13.814520
2017-11-16 02:33:13,815 [salt.state       ][INFO    ][22755] Executing state cmd.wait for python -c "import yaml; stream = file('/etc/salt/grains.d/salt', 'r'); yaml.load(stream); stream.close()"
2017-11-16 02:33:13,815 [salt.state       ][INFO    ][22755] No changes made for python -c "import yaml; stream = file('/etc/salt/grains.d/salt', 'r'); yaml.load(stream); stream.close()"
2017-11-16 02:33:13,815 [salt.state       ][INFO    ][22755] Completed state [python -c "import yaml; stream = file('/etc/salt/grains.d/salt', 'r'); yaml.load(stream); stream.close()"] at time 02:33:13.815158 duration_in_ms=0.638
2017-11-16 02:33:13,816 [salt.state       ][INFO    ][22755] Running state [cat /etc/salt/grains.d/* > /etc/salt/grains] at time 02:33:13.816379
2017-11-16 02:33:13,817 [salt.state       ][INFO    ][22755] Executing state cmd.wait for cat /etc/salt/grains.d/* > /etc/salt/grains
2017-11-16 02:33:13,817 [salt.state       ][INFO    ][22755] No changes made for cat /etc/salt/grains.d/* > /etc/salt/grains
2017-11-16 02:33:13,817 [salt.state       ][INFO    ][22755] Completed state [cat /etc/salt/grains.d/* > /etc/salt/grains] at time 02:33:13.817022 duration_in_ms=0.642
2017-11-16 02:33:13,817 [salt.state       ][INFO    ][22755] Running state [mine.update] at time 02:33:13.817471
2017-11-16 02:33:13,818 [salt.state       ][INFO    ][22755] Executing state module.wait for mine.update
2017-11-16 02:33:13,818 [salt.state       ][INFO    ][22755] No changes made for mine.update
2017-11-16 02:33:13,818 [salt.state       ][INFO    ][22755] Completed state [mine.update] at time 02:33:13.818018 duration_in_ms=0.547
2017-11-16 02:33:13,818 [salt.state       ][INFO    ][22755] Running state [ca-certificates] at time 02:33:13.818215
2017-11-16 02:33:13,818 [salt.state       ][INFO    ][22755] Executing state pkg.installed for ca-certificates
2017-11-16 02:33:13,822 [salt.state       ][INFO    ][22755] Package ca-certificates is already installed
2017-11-16 02:33:13,822 [salt.state       ][INFO    ][22755] Completed state [ca-certificates] at time 02:33:13.821729 duration_in_ms=3.514
2017-11-16 02:33:13,822 [salt.state       ][INFO    ][22755] Running state [update-ca-certificates] at time 02:33:13.822252
2017-11-16 02:33:13,822 [salt.state       ][INFO    ][22755] Executing state cmd.wait for update-ca-certificates
2017-11-16 02:33:13,823 [salt.state       ][INFO    ][22755] No changes made for update-ca-certificates
2017-11-16 02:33:13,823 [salt.state       ][INFO    ][22755] Completed state [update-ca-certificates] at time 02:33:13.822892 duration_in_ms=0.639
2017-11-16 02:33:13,823 [salt.state       ][INFO    ][22755] Running state [libvirt-dev] at time 02:33:13.823091
2017-11-16 02:33:13,823 [salt.state       ][INFO    ][22755] Executing state pkg.installed for libvirt-dev
2017-11-16 02:33:13,826 [salt.state       ][INFO    ][22755] Package libvirt-dev is already installed
2017-11-16 02:33:13,826 [salt.state       ][INFO    ][22755] Completed state [libvirt-dev] at time 02:33:13.826256 duration_in_ms=3.165
2017-11-16 02:33:13,827 [salt.state       ][INFO    ][22755] Running state [pkg-config] at time 02:33:13.826473
2017-11-16 02:33:13,827 [salt.state       ][INFO    ][22755] Executing state pkg.installed for pkg-config
2017-11-16 02:33:13,829 [salt.state       ][INFO    ][22755] Package pkg-config is already installed
2017-11-16 02:33:13,830 [salt.state       ][INFO    ][22755] Completed state [pkg-config] at time 02:33:13.829598 duration_in_ms=3.125
2017-11-16 02:33:13,830 [salt.state       ][INFO    ][22755] Running state [virtng.init] at time 02:33:13.829833
2017-11-16 02:33:13,830 [salt.state       ][INFO    ][22755] Executing state module.run for virtng.init
2017-11-16 02:33:13,868 [salt.loaded.int.module.cmdmod][INFO    ][22755] Executing command ['git', '--version'] in directory '/root'
2017-11-16 02:33:13,962 [salt.loaded.int.module.cmdmod][INFO    ][22755] Executing command 'virsh list --all --name| grep -E "^mdb02.baremetal-mcp-ocata-ovs-ha.local$"' in directory '/root'
2017-11-16 02:33:13,983 [salt.state       ][INFO    ][22755] unless execution succeeded
2017-11-16 02:33:13,983 [salt.state       ][INFO    ][22755] Completed state [virtng.init] at time 02:33:13.983117 duration_in_ms=153.284
2017-11-16 02:33:13,983 [salt.state       ][INFO    ][22755] Running state [virt.set_autostart] at time 02:33:13.983392
2017-11-16 02:33:13,984 [salt.state       ][INFO    ][22755] Executing state module.run for virt.set_autostart
2017-11-16 02:33:13,986 [salt.loaded.int.module.cmdmod][INFO    ][22755] Executing command 'virsh list --autostart --name| grep -E "^mdb02.baremetal-mcp-ocata-ovs-ha.local$"' in directory '/root'
2017-11-16 02:33:14,003 [salt.state       ][INFO    ][22755] unless execution succeeded
2017-11-16 02:33:14,003 [salt.state       ][INFO    ][22755] Completed state [virt.set_autostart] at time 02:33:14.003267 duration_in_ms=19.873
2017-11-16 02:33:14,004 [salt.state       ][INFO    ][22755] Running state [virtng.init] at time 02:33:14.003538
2017-11-16 02:33:14,004 [salt.state       ][INFO    ][22755] Executing state module.run for virtng.init
2017-11-16 02:33:14,006 [salt.loaded.int.module.cmdmod][INFO    ][22755] Executing command 'virsh list --all --name| grep -E "^dbs02.baremetal-mcp-ocata-ovs-ha.local$"' in directory '/root'
2017-11-16 02:33:14,020 [salt.state       ][INFO    ][22755] unless execution succeeded
2017-11-16 02:33:14,021 [salt.state       ][INFO    ][22755] Completed state [virtng.init] at time 02:33:14.020498 duration_in_ms=16.975
2017-11-16 02:33:14,021 [salt.state       ][INFO    ][22755] Running state [virt.set_autostart] at time 02:33:14.020747
2017-11-16 02:33:14,021 [salt.state       ][INFO    ][22755] Executing state module.run for virt.set_autostart
2017-11-16 02:33:14,023 [salt.loaded.int.module.cmdmod][INFO    ][22755] Executing command 'virsh list --autostart --name| grep -E "^dbs02.baremetal-mcp-ocata-ovs-ha.local$"' in directory '/root'
2017-11-16 02:33:14,039 [salt.state       ][INFO    ][22755] unless execution succeeded
2017-11-16 02:33:14,039 [salt.state       ][INFO    ][22755] Completed state [virt.set_autostart] at time 02:33:14.039307 duration_in_ms=18.561
2017-11-16 02:33:14,040 [salt.state       ][INFO    ][22755] Running state [virtng.init] at time 02:33:14.039578
2017-11-16 02:33:14,040 [salt.state       ][INFO    ][22755] Executing state module.run for virtng.init
2017-11-16 02:33:14,042 [salt.loaded.int.module.cmdmod][INFO    ][22755] Executing command 'virsh list --all --name| grep -E "^ctl02.baremetal-mcp-ocata-ovs-ha.local$"' in directory '/root'
2017-11-16 02:33:14,058 [salt.state       ][INFO    ][22755] unless execution succeeded
2017-11-16 02:33:14,058 [salt.state       ][INFO    ][22755] Completed state [virtng.init] at time 02:33:14.057814 duration_in_ms=18.236
2017-11-16 02:33:14,058 [salt.state       ][INFO    ][22755] Running state [virt.set_autostart] at time 02:33:14.058066
2017-11-16 02:33:14,058 [salt.state       ][INFO    ][22755] Executing state module.run for virt.set_autostart
2017-11-16 02:33:14,060 [salt.loaded.int.module.cmdmod][INFO    ][22755] Executing command 'virsh list --autostart --name| grep -E "^ctl02.baremetal-mcp-ocata-ovs-ha.local$"' in directory '/root'
2017-11-16 02:33:14,076 [salt.state       ][INFO    ][22755] unless execution succeeded
2017-11-16 02:33:14,076 [salt.state       ][INFO    ][22755] Completed state [virt.set_autostart] at time 02:33:14.076194 duration_in_ms=18.127
2017-11-16 02:33:14,076 [salt.state       ][INFO    ][22755] Running state [virtng.init] at time 02:33:14.076447
2017-11-16 02:33:14,077 [salt.state       ][INFO    ][22755] Executing state module.run for virtng.init
2017-11-16 02:33:14,079 [salt.loaded.int.module.cmdmod][INFO    ][22755] Executing command 'virsh list --all --name| grep -E "^msg02.baremetal-mcp-ocata-ovs-ha.local$"' in directory '/root'
2017-11-16 02:33:14,093 [salt.state       ][INFO    ][22755] unless execution succeeded
2017-11-16 02:33:14,093 [salt.state       ][INFO    ][22755] Completed state [virtng.init] at time 02:33:14.092785 duration_in_ms=16.338
2017-11-16 02:33:14,093 [salt.state       ][INFO    ][22755] Running state [virt.set_autostart] at time 02:33:14.093018
2017-11-16 02:33:14,093 [salt.state       ][INFO    ][22755] Executing state module.run for virt.set_autostart
2017-11-16 02:33:14,095 [salt.loaded.int.module.cmdmod][INFO    ][22755] Executing command 'virsh list --autostart --name| grep -E "^msg02.baremetal-mcp-ocata-ovs-ha.local$"' in directory '/root'
2017-11-16 02:33:14,109 [salt.state       ][INFO    ][22755] unless execution succeeded
2017-11-16 02:33:14,109 [salt.state       ][INFO    ][22755] Completed state [virt.set_autostart] at time 02:33:14.108800 duration_in_ms=15.781
2017-11-16 02:33:14,111 [salt.minion      ][INFO    ][22755] Returning information for job: 20171116023309124553
2017-11-16 02:34:01,790 [salt.minion      ][INFO    ][22407] User sudo_ubuntu Executing command saltutil.sync_all with jid 20171116023401786504
2017-11-16 02:34:01,809 [salt.minion      ][INFO    ][22871] Starting a new job with PID 22871
2017-11-16 02:34:04,446 [salt.state       ][INFO    ][22871] Loading fresh modules for state activity
2017-11-16 02:34:04,466 [salt.state       ][ERROR   ][22871] No contents found in top file
2017-11-16 02:34:04,467 [salt.utils.extmods][INFO    ][22871] Creating module dir '/var/cache/salt/minion/extmods/beacons'
2017-11-16 02:34:04,469 [salt.utils.extmods][INFO    ][22871] Syncing beacons for environment 'base'
2017-11-16 02:34:04,469 [salt.utils.extmods][INFO    ][22871] Loading cache from salt://_beacons, for base)
2017-11-16 02:34:04,470 [salt.fileclient  ][INFO    ][22871] Caching directory '_beacons/' for environment 'base'
2017-11-16 02:34:04,496 [salt.utils.extmods][INFO    ][22871] Syncing modules for environment 'base'
2017-11-16 02:34:04,496 [salt.utils.extmods][INFO    ][22871] Loading cache from salt://_modules, for base)
2017-11-16 02:34:04,496 [salt.fileclient  ][INFO    ][22871] Caching directory '_modules/' for environment 'base'
2017-11-16 02:34:04,536 [salt.fileclient  ][INFO    ][22871] Fetching file from saltenv 'base', ** done ** '_modules/ceph_ng.py'
2017-11-16 02:34:04,545 [salt.fileclient  ][INFO    ][22871] Fetching file from saltenv 'base', ** done ** '_modules/cinderng.py'
2017-11-16 02:34:04,553 [salt.fileclient  ][INFO    ][22871] Fetching file from saltenv 'base', ** done ** '_modules/contrail.py'
2017-11-16 02:34:04,612 [salt.fileclient  ][INFO    ][22871] Fetching file from saltenv 'base', ** done ** '_modules/creds.py'
2017-11-16 02:34:04,619 [salt.fileclient  ][INFO    ][22871] Fetching file from saltenv 'base', ** done ** '_modules/devops_utils.py'
2017-11-16 02:34:04,633 [salt.fileclient  ][INFO    ][22871] Fetching file from saltenv 'base', ** done ** '_modules/encode_json.py'
2017-11-16 02:34:04,661 [salt.fileclient  ][INFO    ][22871] Fetching file from saltenv 'base', ** done ** '_modules/gerrit.py'
2017-11-16 02:34:04,668 [salt.fileclient  ][INFO    ][22871] Fetching file from saltenv 'base', ** done ** '_modules/glanceng.py'
2017-11-16 02:34:04,692 [salt.fileclient  ][INFO    ][22871] Fetching file from saltenv 'base', ** done ** '_modules/heat.py'
2017-11-16 02:34:04,718 [salt.fileclient  ][INFO    ][22871] Fetching file from saltenv 'base', ** done ** '_modules/heka_alarming.py'
2017-11-16 02:34:04,733 [salt.fileclient  ][INFO    ][22871] Fetching file from saltenv 'base', ** done ** '_modules/helm.py'
2017-11-16 02:34:04,740 [salt.fileclient  ][INFO    ][22871] Fetching file from saltenv 'base', ** done ** '_modules/jenkins_common.py'
2017-11-16 02:34:04,747 [salt.fileclient  ][INFO    ][22871] Fetching file from saltenv 'base', ** done ** '_modules/keystone_policy.py'
2017-11-16 02:34:04,776 [salt.fileclient  ][INFO    ][22871] Fetching file from saltenv 'base', ** done ** '_modules/linux_hosts.py'
2017-11-16 02:34:04,791 [salt.fileclient  ][INFO    ][22871] Fetching file from saltenv 'base', ** done ** '_modules/linux_netlink.py'
2017-11-16 02:34:04,816 [salt.fileclient  ][INFO    ][22871] Fetching file from saltenv 'base', ** done ** '_modules/maas.py'
2017-11-16 02:34:04,828 [salt.fileclient  ][INFO    ][22871] Fetching file from saltenv 'base', ** done ** '_modules/maas_client.py'
2017-11-16 02:34:04,840 [salt.fileclient  ][INFO    ][22871] Fetching file from saltenv 'base', ** done ** '_modules/modelutils.py'
2017-11-16 02:34:04,865 [salt.fileclient  ][INFO    ][22871] Fetching file from saltenv 'base', ** done ** '_modules/multipart.py'
2017-11-16 02:34:04,884 [salt.fileclient  ][INFO    ][22871] Fetching file from saltenv 'base', ** done ** '_modules/nagios_alarming.py'
2017-11-16 02:34:04,922 [salt.fileclient  ][INFO    ][22871] Fetching file from saltenv 'base', ** done ** '_modules/neutronng.py'
2017-11-16 02:34:04,939 [salt.fileclient  ][INFO    ][22871] Fetching file from saltenv 'base', ** done ** '_modules/novang.py'
2017-11-16 02:34:04,964 [salt.fileclient  ][INFO    ][22871] Fetching file from saltenv 'base', ** done ** '_modules/reclass.py'
2017-11-16 02:34:04,982 [salt.fileclient  ][INFO    ][22871] Fetching file from saltenv 'base', ** done ** '_modules/rsyslog_util.py'
2017-11-16 02:34:04,994 [salt.fileclient  ][INFO    ][22871] Fetching file from saltenv 'base', ** done ** '_modules/rundeck.py'
2017-11-16 02:34:05,008 [salt.fileclient  ][INFO    ][22871] Fetching file from saltenv 'base', ** done ** '_modules/saltkey.py'
2017-11-16 02:34:05,021 [salt.fileclient  ][INFO    ][22871] Fetching file from saltenv 'base', ** done ** '_modules/saltresource.py'
2017-11-16 02:34:05,041 [salt.fileclient  ][INFO    ][22871] Fetching file from saltenv 'base', ** done ** '_modules/seedng.py'
2017-11-16 02:34:05,066 [salt.fileclient  ][INFO    ][22871] Fetching file from saltenv 'base', ** done ** '_modules/testing/credentials.py'
2017-11-16 02:34:05,118 [salt.fileclient  ][INFO    ][22871] Fetching file from saltenv 'base', ** done ** '_modules/testing/django.py'
2017-11-16 02:34:05,129 [salt.fileclient  ][INFO    ][22871] Fetching file from saltenv 'base', ** done ** '_modules/testing/django_client_proxy.py'
2017-11-16 02:34:05,139 [salt.fileclient  ][INFO    ][22871] Fetching file from saltenv 'base', ** done ** '_modules/utils.py'
2017-11-16 02:34:05,165 [salt.fileclient  ][INFO    ][22871] Fetching file from saltenv 'base', ** done ** '_modules/virtng.py'
2017-11-16 02:34:05,168 [salt.utils.extmods][INFO    ][22871] Copying '/var/cache/salt/minion/files/base/_modules/__init__.py' to '/var/cache/salt/minion/extmods/modules/__init__.py'
2017-11-16 02:34:05,168 [salt.utils.extmods][INFO    ][22871] Copying '/var/cache/salt/minion/files/base/_modules/ceph_ng.py' to '/var/cache/salt/minion/extmods/modules/ceph_ng.py'
2017-11-16 02:34:05,168 [salt.utils.extmods][INFO    ][22871] Copying '/var/cache/salt/minion/files/base/_modules/cinderng.py' to '/var/cache/salt/minion/extmods/modules/cinderng.py'
2017-11-16 02:34:05,169 [salt.utils.extmods][INFO    ][22871] Copying '/var/cache/salt/minion/files/base/_modules/contrail.py' to '/var/cache/salt/minion/extmods/modules/contrail.py'
2017-11-16 02:34:05,169 [salt.utils.extmods][INFO    ][22871] Copying '/var/cache/salt/minion/files/base/_modules/creds.py' to '/var/cache/salt/minion/extmods/modules/creds.py'
2017-11-16 02:34:05,169 [salt.utils.extmods][INFO    ][22871] Copying '/var/cache/salt/minion/files/base/_modules/devops_utils.py' to '/var/cache/salt/minion/extmods/modules/devops_utils.py'
2017-11-16 02:34:05,169 [salt.utils.extmods][INFO    ][22871] Copying '/var/cache/salt/minion/files/base/_modules/encode_json.py' to '/var/cache/salt/minion/extmods/modules/encode_json.py'
2017-11-16 02:34:05,169 [salt.utils.extmods][INFO    ][22871] Copying '/var/cache/salt/minion/files/base/_modules/gerrit.py' to '/var/cache/salt/minion/extmods/modules/gerrit.py'
2017-11-16 02:34:05,170 [salt.utils.extmods][INFO    ][22871] Copying '/var/cache/salt/minion/files/base/_modules/glanceng.py' to '/var/cache/salt/minion/extmods/modules/glanceng.py'
2017-11-16 02:34:05,170 [salt.utils.extmods][INFO    ][22871] Copying '/var/cache/salt/minion/files/base/_modules/heat.py' to '/var/cache/salt/minion/extmods/modules/heat.py'
2017-11-16 02:34:05,170 [salt.utils.extmods][INFO    ][22871] Copying '/var/cache/salt/minion/files/base/_modules/heka_alarming.py' to '/var/cache/salt/minion/extmods/modules/heka_alarming.py'
2017-11-16 02:34:05,170 [salt.utils.extmods][INFO    ][22871] Copying '/var/cache/salt/minion/files/base/_modules/helm.py' to '/var/cache/salt/minion/extmods/modules/helm.py'
2017-11-16 02:34:05,171 [salt.utils.extmods][INFO    ][22871] Copying '/var/cache/salt/minion/files/base/_modules/jenkins_common.py' to '/var/cache/salt/minion/extmods/modules/jenkins_common.py'
2017-11-16 02:34:05,171 [salt.utils.extmods][INFO    ][22871] Copying '/var/cache/salt/minion/files/base/_modules/keystone_policy.py' to '/var/cache/salt/minion/extmods/modules/keystone_policy.py'
2017-11-16 02:34:05,171 [salt.utils.extmods][INFO    ][22871] Copying '/var/cache/salt/minion/files/base/_modules/linux_hosts.py' to '/var/cache/salt/minion/extmods/modules/linux_hosts.py'
2017-11-16 02:34:05,171 [salt.utils.extmods][INFO    ][22871] Copying '/var/cache/salt/minion/files/base/_modules/linux_netlink.py' to '/var/cache/salt/minion/extmods/modules/linux_netlink.py'
2017-11-16 02:34:05,171 [salt.utils.extmods][INFO    ][22871] Copying '/var/cache/salt/minion/files/base/_modules/maas.py' to '/var/cache/salt/minion/extmods/modules/maas.py'
2017-11-16 02:34:05,171 [salt.utils.extmods][INFO    ][22871] Copying '/var/cache/salt/minion/files/base/_modules/maas_client.py' to '/var/cache/salt/minion/extmods/modules/maas_client.py'
2017-11-16 02:34:05,172 [salt.utils.extmods][INFO    ][22871] Copying '/var/cache/salt/minion/files/base/_modules/modelutils.py' to '/var/cache/salt/minion/extmods/modules/modelutils.py'
2017-11-16 02:34:05,172 [salt.utils.extmods][INFO    ][22871] Copying '/var/cache/salt/minion/files/base/_modules/multipart.py' to '/var/cache/salt/minion/extmods/modules/multipart.py'
2017-11-16 02:34:05,172 [salt.utils.extmods][INFO    ][22871] Copying '/var/cache/salt/minion/files/base/_modules/nagios_alarming.py' to '/var/cache/salt/minion/extmods/modules/nagios_alarming.py'
2017-11-16 02:34:05,172 [salt.utils.extmods][INFO    ][22871] Copying '/var/cache/salt/minion/files/base/_modules/neutronng.py' to '/var/cache/salt/minion/extmods/modules/neutronng.py'
2017-11-16 02:34:05,172 [salt.utils.extmods][INFO    ][22871] Copying '/var/cache/salt/minion/files/base/_modules/novang.py' to '/var/cache/salt/minion/extmods/modules/novang.py'
2017-11-16 02:34:05,173 [salt.utils.extmods][INFO    ][22871] Copying '/var/cache/salt/minion/files/base/_modules/reclass.py' to '/var/cache/salt/minion/extmods/modules/reclass.py'
2017-11-16 02:34:05,173 [salt.utils.extmods][INFO    ][22871] Copying '/var/cache/salt/minion/files/base/_modules/rsyslog_util.py' to '/var/cache/salt/minion/extmods/modules/rsyslog_util.py'
2017-11-16 02:34:05,173 [salt.utils.extmods][INFO    ][22871] Copying '/var/cache/salt/minion/files/base/_modules/rundeck.py' to '/var/cache/salt/minion/extmods/modules/rundeck.py'
2017-11-16 02:34:05,174 [salt.utils.extmods][INFO    ][22871] Copying '/var/cache/salt/minion/files/base/_modules/saltkey.py' to '/var/cache/salt/minion/extmods/modules/saltkey.py'
2017-11-16 02:34:05,174 [salt.utils.extmods][INFO    ][22871] Copying '/var/cache/salt/minion/files/base/_modules/saltresource.py' to '/var/cache/salt/minion/extmods/modules/saltresource.py'
2017-11-16 02:34:05,174 [salt.utils.extmods][INFO    ][22871] Copying '/var/cache/salt/minion/files/base/_modules/seedng.py' to '/var/cache/salt/minion/extmods/modules/seedng.py'
2017-11-16 02:34:05,174 [salt.utils.extmods][INFO    ][22871] Copying '/var/cache/salt/minion/files/base/_modules/testing/__init__.py' to '/var/cache/salt/minion/extmods/modules/testing/__init__.py'
2017-11-16 02:34:05,174 [salt.utils.extmods][INFO    ][22871] Copying '/var/cache/salt/minion/files/base/_modules/testing/credentials.py' to '/var/cache/salt/minion/extmods/modules/testing/credentials.py'
2017-11-16 02:34:05,175 [salt.utils.extmods][INFO    ][22871] Copying '/var/cache/salt/minion/files/base/_modules/testing/django.py' to '/var/cache/salt/minion/extmods/modules/testing/django.py'
2017-11-16 02:34:05,175 [salt.utils.extmods][INFO    ][22871] Copying '/var/cache/salt/minion/files/base/_modules/testing/django_client_proxy.py' to '/var/cache/salt/minion/extmods/modules/testing/django_client_proxy.py'
2017-11-16 02:34:05,175 [salt.utils.extmods][INFO    ][22871] Copying '/var/cache/salt/minion/files/base/_modules/utils.py' to '/var/cache/salt/minion/extmods/modules/utils.py'
2017-11-16 02:34:05,175 [salt.utils.extmods][INFO    ][22871] Copying '/var/cache/salt/minion/files/base/_modules/virtng.py' to '/var/cache/salt/minion/extmods/modules/virtng.py'
2017-11-16 02:34:05,179 [salt.utils.extmods][INFO    ][22871] Syncing states for environment 'base'
2017-11-16 02:34:05,180 [salt.utils.extmods][INFO    ][22871] Loading cache from salt://_states, for base)
2017-11-16 02:34:05,180 [salt.fileclient  ][INFO    ][22871] Caching directory '_states/' for environment 'base'
2017-11-16 02:34:05,212 [salt.fileclient  ][INFO    ][22871] Fetching file from saltenv 'base', ** done ** '_states/cinderng.py'
2017-11-16 02:34:05,231 [salt.fileclient  ][INFO    ][22871] Fetching file from saltenv 'base', ** done ** '_states/contrail.py'
2017-11-16 02:34:05,238 [salt.fileclient  ][INFO    ][22871] Fetching file from saltenv 'base', ** done ** '_states/gerrit.py'
2017-11-16 02:34:05,248 [salt.fileclient  ][INFO    ][22871] Fetching file from saltenv 'base', ** done ** '_states/glanceng.py'
2017-11-16 02:34:05,263 [salt.fileclient  ][INFO    ][22871] Fetching file from saltenv 'base', ** done ** '_states/grafana3_dashboard.py'
2017-11-16 02:34:05,272 [salt.fileclient  ][INFO    ][22871] Fetching file from saltenv 'base', ** done ** '_states/grafana3_datasource.py'
2017-11-16 02:34:05,281 [salt.fileclient  ][INFO    ][22871] Fetching file from saltenv 'base', ** done ** '_states/heat.py'
2017-11-16 02:34:05,301 [salt.fileclient  ][INFO    ][22871] Fetching file from saltenv 'base', ** done ** '_states/helm_release.py'
2017-11-16 02:34:05,326 [salt.fileclient  ][INFO    ][22871] Fetching file from saltenv 'base', ** done ** '_states/jenkins_approval.py'
2017-11-16 02:34:05,334 [salt.fileclient  ][INFO    ][22871] Fetching file from saltenv 'base', ** done ** '_states/jenkins_artifactory.py'
2017-11-16 02:34:05,345 [salt.fileclient  ][INFO    ][22871] Fetching file from saltenv 'base', ** done ** '_states/jenkins_credential.py'
2017-11-16 02:34:05,356 [salt.fileclient  ][INFO    ][22871] Fetching file from saltenv 'base', ** done ** '_states/jenkins_job.py'
2017-11-16 02:34:05,377 [salt.fileclient  ][INFO    ][22871] Fetching file from saltenv 'base', ** done ** '_states/jenkins_lib.py'
2017-11-16 02:34:05,394 [salt.fileclient  ][INFO    ][22871] Fetching file from saltenv 'base', ** done ** '_states/jenkins_node.py'
2017-11-16 02:34:05,401 [salt.fileclient  ][INFO    ][22871] Fetching file from saltenv 'base', ** done ** '_states/jenkins_plugin.py'
2017-11-16 02:34:05,408 [salt.fileclient  ][INFO    ][22871] Fetching file from saltenv 'base', ** done ** '_states/jenkins_security.py'
2017-11-16 02:34:05,414 [salt.fileclient  ][INFO    ][22871] Fetching file from saltenv 'base', ** done ** '_states/jenkins_slack.py'
2017-11-16 02:34:05,422 [salt.fileclient  ][INFO    ][22871] Fetching file from saltenv 'base', ** done ** '_states/jenkins_smtp.py'
2017-11-16 02:34:05,454 [salt.fileclient  ][INFO    ][22871] Fetching file from saltenv 'base', ** done ** '_states/jenkins_theme.py'
2017-11-16 02:34:05,463 [salt.fileclient  ][INFO    ][22871] Fetching file from saltenv 'base', ** done ** '_states/jenkins_user.py'
2017-11-16 02:34:05,472 [salt.fileclient  ][INFO    ][22871] Fetching file from saltenv 'base', ** done ** '_states/jenkins_view.py'
2017-11-16 02:34:05,499 [salt.fileclient  ][INFO    ][22871] Fetching file from saltenv 'base', ** done ** '_states/keystone_policy.py'
2017-11-16 02:34:05,506 [salt.fileclient  ][INFO    ][22871] Fetching file from saltenv 'base', ** done ** '_states/kibana_object.py'
2017-11-16 02:34:05,558 [salt.fileclient  ][INFO    ][22871] Fetching file from saltenv 'base', ** done ** '_states/neutronng.py'
2017-11-16 02:34:05,589 [salt.fileclient  ][INFO    ][22871] Fetching file from saltenv 'base', ** done ** '_states/novang.py'
2017-11-16 02:34:05,599 [salt.fileclient  ][INFO    ][22871] Fetching file from saltenv 'base', ** done ** '_states/reclass.py'
2017-11-16 02:34:05,621 [salt.fileclient  ][INFO    ][22871] Fetching file from saltenv 'base', ** done ** '_states/rundeck_project.py'
2017-11-16 02:34:05,649 [salt.fileclient  ][INFO    ][22871] Fetching file from saltenv 'base', ** done ** '_states/rundeck_scm.py'
2017-11-16 02:34:05,682 [salt.fileclient  ][INFO    ][22871] Fetching file from saltenv 'base', ** done ** '_states/rundeck_secret.py'
2017-11-16 02:34:05,685 [salt.utils.extmods][INFO    ][22871] Copying '/var/cache/salt/minion/files/base/_states/cinderng.py' to '/var/cache/salt/minion/extmods/states/cinderng.py'
2017-11-16 02:34:05,685 [salt.utils.extmods][INFO    ][22871] Copying '/var/cache/salt/minion/files/base/_states/contrail.py' to '/var/cache/salt/minion/extmods/states/contrail.py'
2017-11-16 02:34:05,685 [salt.utils.extmods][INFO    ][22871] Copying '/var/cache/salt/minion/files/base/_states/gerrit.py' to '/var/cache/salt/minion/extmods/states/gerrit.py'
2017-11-16 02:34:05,686 [salt.utils.extmods][INFO    ][22871] Copying '/var/cache/salt/minion/files/base/_states/glanceng.py' to '/var/cache/salt/minion/extmods/states/glanceng.py'
2017-11-16 02:34:05,686 [salt.utils.extmods][INFO    ][22871] Copying '/var/cache/salt/minion/files/base/_states/grafana3_dashboard.py' to '/var/cache/salt/minion/extmods/states/grafana3_dashboard.py'
2017-11-16 02:34:05,686 [salt.utils.extmods][INFO    ][22871] Copying '/var/cache/salt/minion/files/base/_states/grafana3_datasource.py' to '/var/cache/salt/minion/extmods/states/grafana3_datasource.py'
2017-11-16 02:34:05,686 [salt.utils.extmods][INFO    ][22871] Copying '/var/cache/salt/minion/files/base/_states/heat.py' to '/var/cache/salt/minion/extmods/states/heat.py'
2017-11-16 02:34:05,687 [salt.utils.extmods][INFO    ][22871] Copying '/var/cache/salt/minion/files/base/_states/helm_release.py' to '/var/cache/salt/minion/extmods/states/helm_release.py'
2017-11-16 02:34:05,687 [salt.utils.extmods][INFO    ][22871] Copying '/var/cache/salt/minion/files/base/_states/jenkins_approval.py' to '/var/cache/salt/minion/extmods/states/jenkins_approval.py'
2017-11-16 02:34:05,687 [salt.utils.extmods][INFO    ][22871] Copying '/var/cache/salt/minion/files/base/_states/jenkins_artifactory.py' to '/var/cache/salt/minion/extmods/states/jenkins_artifactory.py'
2017-11-16 02:34:05,687 [salt.utils.extmods][INFO    ][22871] Copying '/var/cache/salt/minion/files/base/_states/jenkins_credential.py' to '/var/cache/salt/minion/extmods/states/jenkins_credential.py'
2017-11-16 02:34:05,688 [salt.utils.extmods][INFO    ][22871] Copying '/var/cache/salt/minion/files/base/_states/jenkins_job.py' to '/var/cache/salt/minion/extmods/states/jenkins_job.py'
2017-11-16 02:34:05,688 [salt.utils.extmods][INFO    ][22871] Copying '/var/cache/salt/minion/files/base/_states/jenkins_lib.py' to '/var/cache/salt/minion/extmods/states/jenkins_lib.py'
2017-11-16 02:34:05,688 [salt.utils.extmods][INFO    ][22871] Copying '/var/cache/salt/minion/files/base/_states/jenkins_node.py' to '/var/cache/salt/minion/extmods/states/jenkins_node.py'
2017-11-16 02:34:05,688 [salt.utils.extmods][INFO    ][22871] Copying '/var/cache/salt/minion/files/base/_states/jenkins_plugin.py' to '/var/cache/salt/minion/extmods/states/jenkins_plugin.py'
2017-11-16 02:34:05,688 [salt.utils.extmods][INFO    ][22871] Copying '/var/cache/salt/minion/files/base/_states/jenkins_security.py' to '/var/cache/salt/minion/extmods/states/jenkins_security.py'
2017-11-16 02:34:05,689 [salt.utils.extmods][INFO    ][22871] Copying '/var/cache/salt/minion/files/base/_states/jenkins_slack.py' to '/var/cache/salt/minion/extmods/states/jenkins_slack.py'
2017-11-16 02:34:05,689 [salt.utils.extmods][INFO    ][22871] Copying '/var/cache/salt/minion/files/base/_states/jenkins_smtp.py' to '/var/cache/salt/minion/extmods/states/jenkins_smtp.py'
2017-11-16 02:34:05,689 [salt.utils.extmods][INFO    ][22871] Copying '/var/cache/salt/minion/files/base/_states/jenkins_theme.py' to '/var/cache/salt/minion/extmods/states/jenkins_theme.py'
2017-11-16 02:34:05,690 [salt.utils.extmods][INFO    ][22871] Copying '/var/cache/salt/minion/files/base/_states/jenkins_user.py' to '/var/cache/salt/minion/extmods/states/jenkins_user.py'
2017-11-16 02:34:05,690 [salt.utils.extmods][INFO    ][22871] Copying '/var/cache/salt/minion/files/base/_states/jenkins_view.py' to '/var/cache/salt/minion/extmods/states/jenkins_view.py'
2017-11-16 02:34:05,690 [salt.utils.extmods][INFO    ][22871] Copying '/var/cache/salt/minion/files/base/_states/keystone_policy.py' to '/var/cache/salt/minion/extmods/states/keystone_policy.py'
2017-11-16 02:34:05,690 [salt.utils.extmods][INFO    ][22871] Copying '/var/cache/salt/minion/files/base/_states/kibana_object.py' to '/var/cache/salt/minion/extmods/states/kibana_object.py'
2017-11-16 02:34:05,691 [salt.utils.extmods][INFO    ][22871] Copying '/var/cache/salt/minion/files/base/_states/maas_cluster.py' to '/var/cache/salt/minion/extmods/states/maas_cluster.py'
2017-11-16 02:34:05,691 [salt.utils.extmods][INFO    ][22871] Copying '/var/cache/salt/minion/files/base/_states/neutronng.py' to '/var/cache/salt/minion/extmods/states/neutronng.py'
2017-11-16 02:34:05,691 [salt.utils.extmods][INFO    ][22871] Copying '/var/cache/salt/minion/files/base/_states/novang.py' to '/var/cache/salt/minion/extmods/states/novang.py'
2017-11-16 02:34:05,691 [salt.utils.extmods][INFO    ][22871] Copying '/var/cache/salt/minion/files/base/_states/reclass.py' to '/var/cache/salt/minion/extmods/states/reclass.py'
2017-11-16 02:34:05,691 [salt.utils.extmods][INFO    ][22871] Copying '/var/cache/salt/minion/files/base/_states/rundeck_project.py' to '/var/cache/salt/minion/extmods/states/rundeck_project.py'
2017-11-16 02:34:05,692 [salt.utils.extmods][INFO    ][22871] Copying '/var/cache/salt/minion/files/base/_states/rundeck_scm.py' to '/var/cache/salt/minion/extmods/states/rundeck_scm.py'
2017-11-16 02:34:05,692 [salt.utils.extmods][INFO    ][22871] Copying '/var/cache/salt/minion/files/base/_states/rundeck_secret.py' to '/var/cache/salt/minion/extmods/states/rundeck_secret.py'
2017-11-16 02:34:05,694 [salt.utils.extmods][INFO    ][22871] Creating module dir '/var/cache/salt/minion/extmods/sdb'
2017-11-16 02:34:05,696 [salt.utils.extmods][INFO    ][22871] Syncing sdb for environment 'base'
2017-11-16 02:34:05,697 [salt.utils.extmods][INFO    ][22871] Loading cache from salt://_sdb, for base)
2017-11-16 02:34:05,697 [salt.fileclient  ][INFO    ][22871] Caching directory '_sdb/' for environment 'base'
2017-11-16 02:34:05,751 [salt.utils.extmods][INFO    ][22871] Syncing grains for environment 'base'
2017-11-16 02:34:05,752 [salt.utils.extmods][INFO    ][22871] Loading cache from salt://_grains, for base)
2017-11-16 02:34:05,752 [salt.fileclient  ][INFO    ][22871] Caching directory '_grains/' for environment 'base'
2017-11-16 02:34:05,797 [salt.fileclient  ][INFO    ][22871] Fetching file from saltenv 'base', ** done ** '_grains/ceilometer_policy.py'
2017-11-16 02:34:05,807 [salt.fileclient  ][INFO    ][22871] Fetching file from saltenv 'base', ** done ** '_grains/ceph.py'
2017-11-16 02:34:05,817 [salt.fileclient  ][INFO    ][22871] Fetching file from saltenv 'base', ** done ** '_grains/cinder_policy.py'
2017-11-16 02:34:05,838 [salt.fileclient  ][INFO    ][22871] Fetching file from saltenv 'base', ** done ** '_grains/docker_swarm.py'
2017-11-16 02:34:05,850 [salt.fileclient  ][INFO    ][22871] Fetching file from saltenv 'base', ** done ** '_grains/glance_policy.py'
2017-11-16 02:34:05,867 [salt.fileclient  ][INFO    ][22871] Fetching file from saltenv 'base', ** done ** '_grains/heat_policy.py'
2017-11-16 02:34:05,874 [salt.fileclient  ][INFO    ][22871] Fetching file from saltenv 'base', ** done ** '_grains/jenkins_plugins.py'
2017-11-16 02:34:05,890 [salt.fileclient  ][INFO    ][22871] Fetching file from saltenv 'base', ** done ** '_grains/keystone_policy.py'
2017-11-16 02:34:05,911 [salt.fileclient  ][INFO    ][22871] Fetching file from saltenv 'base', ** done ** '_grains/kubernetes.py'
2017-11-16 02:34:05,922 [salt.fileclient  ][INFO    ][22871] Fetching file from saltenv 'base', ** done ** '_grains/neutron_policy.py'
2017-11-16 02:34:05,934 [salt.fileclient  ][INFO    ][22871] Fetching file from saltenv 'base', ** done ** '_grains/nova_policy.py'
2017-11-16 02:34:05,945 [salt.fileclient  ][INFO    ][22871] Fetching file from saltenv 'base', ** done ** '_grains/ssh_fingerprints.py'
2017-11-16 02:34:05,947 [salt.utils.extmods][INFO    ][22871] Copying '/var/cache/salt/minion/files/base/_grains/ceilometer_policy.py' to '/var/cache/salt/minion/extmods/grains/ceilometer_policy.py'
2017-11-16 02:34:05,948 [salt.utils.extmods][INFO    ][22871] Copying '/var/cache/salt/minion/files/base/_grains/ceph.py' to '/var/cache/salt/minion/extmods/grains/ceph.py'
2017-11-16 02:34:05,948 [salt.utils.extmods][INFO    ][22871] Copying '/var/cache/salt/minion/files/base/_grains/cinder_policy.py' to '/var/cache/salt/minion/extmods/grains/cinder_policy.py'
2017-11-16 02:34:05,948 [salt.utils.extmods][INFO    ][22871] Copying '/var/cache/salt/minion/files/base/_grains/docker_swarm.py' to '/var/cache/salt/minion/extmods/grains/docker_swarm.py'
2017-11-16 02:34:05,948 [salt.utils.extmods][INFO    ][22871] Copying '/var/cache/salt/minion/files/base/_grains/glance_policy.py' to '/var/cache/salt/minion/extmods/grains/glance_policy.py'
2017-11-16 02:34:05,949 [salt.utils.extmods][INFO    ][22871] Copying '/var/cache/salt/minion/files/base/_grains/heat_policy.py' to '/var/cache/salt/minion/extmods/grains/heat_policy.py'
2017-11-16 02:34:05,949 [salt.utils.extmods][INFO    ][22871] Copying '/var/cache/salt/minion/files/base/_grains/jenkins_plugins.py' to '/var/cache/salt/minion/extmods/grains/jenkins_plugins.py'
2017-11-16 02:34:05,949 [salt.utils.extmods][INFO    ][22871] Copying '/var/cache/salt/minion/files/base/_grains/keystone_policy.py' to '/var/cache/salt/minion/extmods/grains/keystone_policy.py'
2017-11-16 02:34:05,949 [salt.utils.extmods][INFO    ][22871] Copying '/var/cache/salt/minion/files/base/_grains/kubernetes.py' to '/var/cache/salt/minion/extmods/grains/kubernetes.py'
2017-11-16 02:34:05,950 [salt.utils.extmods][INFO    ][22871] Copying '/var/cache/salt/minion/files/base/_grains/neutron_policy.py' to '/var/cache/salt/minion/extmods/grains/neutron_policy.py'
2017-11-16 02:34:05,950 [salt.utils.extmods][INFO    ][22871] Copying '/var/cache/salt/minion/files/base/_grains/nova_policy.py' to '/var/cache/salt/minion/extmods/grains/nova_policy.py'
2017-11-16 02:34:05,950 [salt.utils.extmods][INFO    ][22871] Copying '/var/cache/salt/minion/files/base/_grains/ssh_fingerprints.py' to '/var/cache/salt/minion/extmods/grains/ssh_fingerprints.py'
2017-11-16 02:34:05,951 [salt.utils.extmods][INFO    ][22871] Creating module dir '/var/cache/salt/minion/extmods/renderers'
2017-11-16 02:34:05,953 [salt.utils.extmods][INFO    ][22871] Syncing renderers for environment 'base'
2017-11-16 02:34:05,954 [salt.utils.extmods][INFO    ][22871] Loading cache from salt://_renderers, for base)
2017-11-16 02:34:05,954 [salt.fileclient  ][INFO    ][22871] Caching directory '_renderers/' for environment 'base'
2017-11-16 02:34:05,994 [salt.utils.extmods][INFO    ][22871] Creating module dir '/var/cache/salt/minion/extmods/returners'
2017-11-16 02:34:05,996 [salt.utils.extmods][INFO    ][22871] Syncing returners for environment 'base'
2017-11-16 02:34:05,996 [salt.utils.extmods][INFO    ][22871] Loading cache from salt://_returners, for base)
2017-11-16 02:34:05,996 [salt.fileclient  ][INFO    ][22871] Caching directory '_returners/' for environment 'base'
2017-11-16 02:34:06,023 [salt.utils.extmods][INFO    ][22871] Creating module dir '/var/cache/salt/minion/extmods/output'
2017-11-16 02:34:06,025 [salt.utils.extmods][INFO    ][22871] Syncing output for environment 'base'
2017-11-16 02:34:06,025 [salt.utils.extmods][INFO    ][22871] Loading cache from salt://_output, for base)
2017-11-16 02:34:06,025 [salt.fileclient  ][INFO    ][22871] Caching directory '_output/' for environment 'base'
2017-11-16 02:34:06,055 [salt.utils.extmods][INFO    ][22871] Creating module dir '/var/cache/salt/minion/extmods/utils'
2017-11-16 02:34:06,057 [salt.utils.extmods][INFO    ][22871] Syncing utils for environment 'base'
2017-11-16 02:34:06,057 [salt.utils.extmods][INFO    ][22871] Loading cache from salt://_utils, for base)
2017-11-16 02:34:06,057 [salt.fileclient  ][INFO    ][22871] Caching directory '_utils/' for environment 'base'
2017-11-16 02:34:06,099 [salt.utils.extmods][INFO    ][22871] Creating module dir '/var/cache/salt/minion/extmods/log_handlers'
2017-11-16 02:34:06,101 [salt.utils.extmods][INFO    ][22871] Syncing log_handlers for environment 'base'
2017-11-16 02:34:06,102 [salt.utils.extmods][INFO    ][22871] Loading cache from salt://_log_handlers, for base)
2017-11-16 02:34:06,102 [salt.fileclient  ][INFO    ][22871] Caching directory '_log_handlers/' for environment 'base'
2017-11-16 02:34:06,123 [salt.utils.extmods][INFO    ][22871] Creating module dir '/var/cache/salt/minion/extmods/proxy'
2017-11-16 02:34:06,125 [salt.utils.extmods][INFO    ][22871] Syncing proxy for environment 'base'
2017-11-16 02:34:06,125 [salt.utils.extmods][INFO    ][22871] Loading cache from salt://_proxy, for base)
2017-11-16 02:34:06,125 [salt.fileclient  ][INFO    ][22871] Caching directory '_proxy/' for environment 'base'
2017-11-16 02:34:06,146 [salt.utils.extmods][INFO    ][22871] Creating module dir '/var/cache/salt/minion/extmods/engines'
2017-11-16 02:34:06,149 [salt.utils.extmods][INFO    ][22871] Syncing engines for environment 'base'
2017-11-16 02:34:06,149 [salt.utils.extmods][INFO    ][22871] Loading cache from salt://_engines, for base)
2017-11-16 02:34:06,149 [salt.fileclient  ][INFO    ][22871] Caching directory '_engines/' for environment 'base'
2017-11-16 02:34:06,198 [salt.minion      ][INFO    ][22871] Returning information for job: 20171116023401786504
2017-11-16 02:39:58,910 [salt.minion      ][INFO    ][22407] User sudo_ubuntu Executing command test.ping with jid 20171116023958901302
2017-11-16 02:39:58,928 [salt.minion      ][INFO    ][23027] Starting a new job with PID 23027
2017-11-16 02:39:58,951 [salt.minion      ][INFO    ][23027] Returning information for job: 20171116023958901302
2017-11-16 02:43:24,181 [salt.minion      ][INFO    ][22407] User sudo_ubuntu Executing command state.sls with jid 20171116024324171644
2017-11-16 02:43:24,195 [salt.minion      ][INFO    ][23084] Starting a new job with PID 23084
2017-11-16 02:43:25,690 [salt.state       ][INFO    ][23084] Loading fresh modules for state activity
2017-11-16 02:43:25,715 [salt.fileclient  ][INFO    ][23084] Fetching file from saltenv 'base', ** done ** 'keepalived/init.sls'
2017-11-16 02:43:25,732 [salt.fileclient  ][INFO    ][23084] Fetching file from saltenv 'base', ** done ** 'keepalived/cluster.sls'
2017-11-16 02:43:25,757 [salt.fileclient  ][INFO    ][23084] Fetching file from saltenv 'base', ** done ** 'keepalived/map.jinja'
2017-11-16 02:43:26,048 [salt.state       ][INFO    ][23084] Running state [lsof] at time 02:43:26.048460
2017-11-16 02:43:26,049 [salt.state       ][INFO    ][23084] Executing state pkg.installed for lsof
2017-11-16 02:43:26,049 [salt.loaded.int.module.cmdmod][INFO    ][23084] Executing command ['dpkg-query', '--showformat', '${Status} ${Package} ${Version} ${Architecture}\n', '-W'] in directory '/root'
2017-11-16 02:43:26,278 [salt.state       ][INFO    ][23084] Package lsof is already installed
2017-11-16 02:43:26,278 [salt.state       ][INFO    ][23084] Completed state [lsof] at time 02:43:26.277968 duration_in_ms=229.507
2017-11-16 02:43:26,278 [salt.state       ][INFO    ][23084] Running state [keepalived] at time 02:43:26.278173
2017-11-16 02:43:26,278 [salt.state       ][INFO    ][23084] Executing state pkg.installed for keepalived
2017-11-16 02:43:26,294 [salt.loaded.int.module.cmdmod][INFO    ][23084] Executing command ['apt-get', '-q', 'update'] in directory '/root'
2017-11-16 02:43:27,827 [salt.loaded.int.module.cmdmod][INFO    ][23084] Executing command ['systemd-run', '--scope', 'apt-get', '-q', '-y', '-o', 'DPkg::Options::=--force-confold', '-o', 'DPkg::Options::=--force-confdef', 'install', 'keepalived'] in directory '/root'
2017-11-16 02:43:34,226 [salt.minion      ][INFO    ][22407] User sudo_ubuntu Executing command saltutil.find_job with jid 20171116024334216352
2017-11-16 02:43:34,240 [salt.minion      ][INFO    ][24421] Starting a new job with PID 24421
2017-11-16 02:43:34,259 [salt.minion      ][INFO    ][24421] Returning information for job: 20171116024334216352
2017-11-16 02:43:35,789 [salt.loaded.int.module.cmdmod][INFO    ][23084] Executing command ['dpkg-query', '--showformat', '${Status} ${Package} ${Version} ${Architecture}\n', '-W'] in directory '/root'
2017-11-16 02:43:35,813 [salt.state       ][INFO    ][23084] Made the following changes:
'libsnmp30' changed from 'absent' to '5.7.3+dfsg-1ubuntu4'
'libsnmp-base' changed from 'absent' to '5.7.3+dfsg-1ubuntu4'
'keepalived' changed from 'absent' to '1:1.2.19-1ubuntu0.2'
'ipvsadm' changed from 'absent' to '1:1.28-3'
'libsensors4' changed from 'absent' to '1:3.4.0-2'

2017-11-16 02:43:35,821 [salt.state       ][INFO    ][23084] Loading fresh modules for state activity
2017-11-16 02:43:35,834 [salt.state       ][INFO    ][23084] Completed state [keepalived] at time 02:43:35.833604 duration_in_ms=9555.431
2017-11-16 02:43:35,835 [salt.state       ][INFO    ][23084] Running state [/etc/keepalived/keepalived.conf] at time 02:43:35.835441
2017-11-16 02:43:35,836 [salt.state       ][INFO    ][23084] Executing state file.managed for /etc/keepalived/keepalived.conf
2017-11-16 02:43:35,866 [salt.fileclient  ][INFO    ][23084] Fetching file from saltenv 'base', ** done ** 'keepalived/files/keepalived.conf'
2017-11-16 02:43:35,899 [salt.fileclient  ][INFO    ][23084] Fetching file from saltenv 'base', ** done ** 'keepalived/map.jinja'
2017-11-16 02:43:35,905 [salt.state       ][INFO    ][23084] File changed:
New file
2017-11-16 02:43:35,906 [salt.state       ][INFO    ][23084] Completed state [/etc/keepalived/keepalived.conf] at time 02:43:35.905537 duration_in_ms=70.095
2017-11-16 02:43:35,962 [salt.state       ][INFO    ][23084] Running state [keepalived] at time 02:43:35.961707
2017-11-16 02:43:35,962 [salt.state       ][INFO    ][23084] Executing state service.running for keepalived
2017-11-16 02:43:35,963 [salt.loaded.int.module.cmdmod][INFO    ][23084] Executing command ['systemctl', 'status', 'keepalived.service', '-n', '0'] in directory '/root'
2017-11-16 02:43:35,973 [salt.loaded.int.module.cmdmod][INFO    ][23084] Executing command ['systemctl', 'is-active', 'keepalived.service'] in directory '/root'
2017-11-16 02:43:35,980 [salt.loaded.int.module.cmdmod][INFO    ][23084] Executing command ['systemctl', 'is-enabled', 'keepalived.service'] in directory '/root'
2017-11-16 02:43:35,987 [salt.loaded.int.module.cmdmod][INFO    ][23084] Executing command ['systemctl', 'is-enabled', 'keepalived.service'] in directory '/root'
2017-11-16 02:43:35,995 [salt.loaded.int.module.cmdmod][INFO    ][23084] Executing command ['systemd-run', '--scope', 'systemctl', 'start', 'keepalived.service'] in directory '/root'
2017-11-16 02:43:36,038 [salt.loaded.int.module.cmdmod][INFO    ][23084] Executing command ['systemctl', 'is-active', 'keepalived.service'] in directory '/root'
2017-11-16 02:43:36,047 [salt.loaded.int.module.cmdmod][INFO    ][23084] Executing command ['systemctl', 'is-enabled', 'keepalived.service'] in directory '/root'
2017-11-16 02:43:36,054 [salt.loaded.int.module.cmdmod][INFO    ][23084] Executing command ['systemctl', 'is-enabled', 'keepalived.service'] in directory '/root'
2017-11-16 02:43:36,061 [salt.state       ][INFO    ][23084] {'keepalived': True}
2017-11-16 02:43:36,061 [salt.state       ][INFO    ][23084] Completed state [keepalived] at time 02:43:36.061170 duration_in_ms=99.464
2017-11-16 02:43:36,062 [salt.minion      ][INFO    ][23084] Returning information for job: 20171116024324171644
2017-11-16 02:44:01,051 [salt.minion      ][INFO    ][22407] User sudo_ubuntu Executing command pillar.get with jid 20171116024401041139
2017-11-16 02:44:01,070 [salt.minion      ][INFO    ][24656] Starting a new job with PID 24656
2017-11-16 02:44:01,078 [salt.minion      ][INFO    ][24656] Returning information for job: 20171116024401041139
2017-11-16 02:49:21,183 [salt.minion      ][INFO    ][22407] User sudo_ubuntu Executing command state.sls with jid 20171116024921173702
2017-11-16 02:49:21,199 [salt.minion      ][INFO    ][24748] Starting a new job with PID 24748
2017-11-16 02:49:22,927 [salt.state       ][INFO    ][24748] Loading fresh modules for state activity
2017-11-16 02:49:22,950 [salt.fileclient  ][INFO    ][24748] Fetching file from saltenv 'base', ** done ** 'glusterfs/server/service.sls'
2017-11-16 02:49:22,975 [salt.fileclient  ][INFO    ][24748] Fetching file from saltenv 'base', ** done ** 'glusterfs/map.jinja'
2017-11-16 02:49:23,240 [salt.state       ][INFO    ][24748] Running state [attr] at time 02:49:23.239473
2017-11-16 02:49:23,240 [salt.state       ][INFO    ][24748] Executing state pkg.installed for attr
2017-11-16 02:49:23,240 [salt.loaded.int.module.cmdmod][INFO    ][24748] Executing command ['dpkg-query', '--showformat', '${Status} ${Package} ${Version} ${Architecture}\n', '-W'] in directory '/root'
2017-11-16 02:49:23,502 [salt.loaded.int.module.cmdmod][INFO    ][24748] Executing command ['apt-get', '-q', 'update'] in directory '/root'
2017-11-16 02:49:25,705 [salt.loaded.int.module.cmdmod][INFO    ][24748] Executing command ['systemd-run', '--scope', 'apt-get', '-q', '-y', '-o', 'DPkg::Options::=--force-confold', '-o', 'DPkg::Options::=--force-confdef', 'install', 'attr'] in directory '/root'
2017-11-16 02:49:28,238 [salt.loaded.int.module.cmdmod][INFO    ][24748] Executing command ['dpkg-query', '--showformat', '${Status} ${Package} ${Version} ${Architecture}\n', '-W'] in directory '/root'
2017-11-16 02:49:28,263 [salt.state       ][INFO    ][24748] Made the following changes:
'attr' changed from 'absent' to '1:2.4.47-2'

2017-11-16 02:49:28,271 [salt.state       ][INFO    ][24748] Loading fresh modules for state activity
2017-11-16 02:49:28,282 [salt.state       ][INFO    ][24748] Completed state [attr] at time 02:49:28.282432 duration_in_ms=5042.96
2017-11-16 02:49:28,287 [salt.state       ][INFO    ][24748] Running state [glusterfs-server] at time 02:49:28.287051
2017-11-16 02:49:28,287 [salt.state       ][INFO    ][24748] Executing state pkg.installed for glusterfs-server
2017-11-16 02:49:28,476 [salt.loaded.int.module.cmdmod][INFO    ][24748] Executing command ['systemd-run', '--scope', 'apt-get', '-q', '-y', '-o', 'DPkg::Options::=--force-confold', '-o', 'DPkg::Options::=--force-confdef', 'install', 'glusterfs-server'] in directory '/root'
2017-11-16 02:49:31,273 [salt.minion      ][INFO    ][22407] User sudo_ubuntu Executing command saltutil.find_job with jid 20171116024931264270
2017-11-16 02:49:31,290 [salt.minion      ][INFO    ][25738] Starting a new job with PID 25738
2017-11-16 02:49:31,300 [salt.minion      ][INFO    ][25738] Returning information for job: 20171116024931264270
2017-11-16 02:49:41,471 [salt.minion      ][INFO    ][22407] User sudo_ubuntu Executing command saltutil.find_job with jid 20171116024941459975
2017-11-16 02:49:41,485 [salt.minion      ][INFO    ][28560] Starting a new job with PID 28560
2017-11-16 02:49:41,501 [salt.minion      ][INFO    ][28560] Returning information for job: 20171116024941459975
2017-11-16 02:49:46,485 [salt.loaded.int.module.cmdmod][INFO    ][24748] Executing command ['dpkg-query', '--showformat', '${Status} ${Package} ${Version} ${Architecture}\n', '-W'] in directory '/root'
2017-11-16 02:49:46,510 [salt.state       ][INFO    ][24748] Made the following changes:
'keyutils' changed from 'absent' to '1.5.9-8ubuntu1'
'nfs-common' changed from 'absent' to '1:1.2.8-9ubuntu12.1'
'rpcbind' changed from 'absent' to '0.2.3-0.2'
'glusterfs-common' changed from 'absent' to '3.7.6-1ubuntu1'
'librdmacm1' changed from 'absent' to '1.0.21-1'
'libnfsidmap2' changed from 'absent' to '0.25-5'
'portmap' changed from 'absent' to '1'
'libattr1-dev' changed from 'absent' to '1:2.4.47-2'
'attr-dev' changed from 'absent' to '1'
'acl-dev' changed from 'absent' to '1'
'glusterfs-server' changed from 'absent' to '3.7.6-1ubuntu1'
'glusterfs-client' changed from 'absent' to '3.7.6-1ubuntu1'
'libpython2.7' changed from 'absent' to '2.7.12-1ubuntu0~16.04.1'
'nfs-client' changed from 'absent' to '1'
'liburcu4' changed from 'absent' to '0.9.1-3'
'libacl1-dev' changed from 'absent' to '2.2.52-3'
'libibverbs1' changed from 'absent' to '1.1.8-1.1ubuntu2'
'libtirpc1' changed from 'absent' to '0.2.5-1'

2017-11-16 02:49:46,517 [salt.state       ][INFO    ][24748] Loading fresh modules for state activity
2017-11-16 02:49:46,529 [salt.state       ][INFO    ][24748] Completed state [glusterfs-server] at time 02:49:46.529288 duration_in_ms=18242.237
2017-11-16 02:49:46,534 [salt.state       ][INFO    ][24748] Running state [bc] at time 02:49:46.533630
2017-11-16 02:49:46,534 [salt.state       ][INFO    ][24748] Executing state pkg.installed for bc
2017-11-16 02:49:46,789 [salt.loaded.int.module.cmdmod][INFO    ][24748] Executing command ['systemd-run', '--scope', 'apt-get', '-q', '-y', '-o', 'DPkg::Options::=--force-confold', '-o', 'DPkg::Options::=--force-confdef', 'install', 'bc'] in directory '/root'
2017-11-16 02:49:49,619 [salt.loaded.int.module.cmdmod][INFO    ][24748] Executing command ['dpkg-query', '--showformat', '${Status} ${Package} ${Version} ${Architecture}\n', '-W'] in directory '/root'
2017-11-16 02:49:49,646 [salt.state       ][INFO    ][24748] Made the following changes:
'bc' changed from 'absent' to '1.06.95-9build1'

2017-11-16 02:49:49,656 [salt.state       ][INFO    ][24748] Loading fresh modules for state activity
2017-11-16 02:49:49,670 [salt.state       ][INFO    ][24748] Completed state [bc] at time 02:49:49.669866 duration_in_ms=3136.235
2017-11-16 02:49:49,736 [salt.state       ][INFO    ][24748] Running state [glusterfs-server] at time 02:49:49.736301
2017-11-16 02:49:49,737 [salt.state       ][INFO    ][24748] Executing state service.running for glusterfs-server
2017-11-16 02:49:49,738 [salt.loaded.int.module.cmdmod][INFO    ][24748] Executing command ['systemctl', 'status', 'glusterfs-server.service', '-n', '0'] in directory '/root'
2017-11-16 02:49:49,747 [salt.loaded.int.module.cmdmod][INFO    ][24748] Executing command ['systemctl', 'is-active', 'glusterfs-server.service'] in directory '/root'
2017-11-16 02:49:49,755 [salt.loaded.int.module.cmdmod][INFO    ][24748] Executing command ['systemctl', 'is-enabled', 'glusterfs-server.service'] in directory '/root'
2017-11-16 02:49:49,764 [salt.state       ][INFO    ][24748] The service glusterfs-server is already running
2017-11-16 02:49:49,764 [salt.state       ][INFO    ][24748] Completed state [glusterfs-server] at time 02:49:49.764187 duration_in_ms=27.885
2017-11-16 02:49:49,768 [salt.state       ][INFO    ][24748] Running state [/etc/systemd/system/glusterfs-server.service.d/override.conf] at time 02:49:49.767768
2017-11-16 02:49:49,768 [salt.state       ][INFO    ][24748] Executing state file.managed for /etc/systemd/system/glusterfs-server.service.d/override.conf
2017-11-16 02:49:49,779 [salt.state       ][INFO    ][24748] File changed:
New file
2017-11-16 02:49:49,779 [salt.state       ][INFO    ][24748] Completed state [/etc/systemd/system/glusterfs-server.service.d/override.conf] at time 02:49:49.779397 duration_in_ms=11.629
2017-11-16 02:49:49,780 [salt.state       ][INFO    ][24748] Running state [/srv/glusterfs/glance] at time 02:49:49.779589
2017-11-16 02:49:49,780 [salt.state       ][INFO    ][24748] Executing state file.directory for /srv/glusterfs/glance
2017-11-16 02:49:49,780 [salt.state       ][INFO    ][24748] {'/srv/glusterfs/glance': 'New Dir'}
2017-11-16 02:49:49,780 [salt.state       ][INFO    ][24748] Completed state [/srv/glusterfs/glance] at time 02:49:49.780440 duration_in_ms=0.851
2017-11-16 02:49:49,781 [salt.state       ][INFO    ][24748] Running state [/srv/glusterfs/keystone-keys] at time 02:49:49.780591
2017-11-16 02:49:49,781 [salt.state       ][INFO    ][24748] Executing state file.directory for /srv/glusterfs/keystone-keys
2017-11-16 02:49:49,781 [salt.state       ][INFO    ][24748] {'/srv/glusterfs/keystone-keys': 'New Dir'}
2017-11-16 02:49:49,781 [salt.state       ][INFO    ][24748] Completed state [/srv/glusterfs/keystone-keys] at time 02:49:49.781251 duration_in_ms=0.659
2017-11-16 02:49:49,781 [salt.state       ][INFO    ][24748] Running state [/srv/glusterfs/nova_instances] at time 02:49:49.781405
2017-11-16 02:49:49,782 [salt.state       ][INFO    ][24748] Executing state file.directory for /srv/glusterfs/nova_instances
2017-11-16 02:49:49,782 [salt.state       ][INFO    ][24748] {'/srv/glusterfs/nova_instances': 'New Dir'}
2017-11-16 02:49:49,782 [salt.state       ][INFO    ][24748] Completed state [/srv/glusterfs/nova_instances] at time 02:49:49.782036 duration_in_ms=0.631
2017-11-16 02:49:49,782 [salt.state       ][INFO    ][24748] Running state [/srv/glusterfs/keystone-credential-keys] at time 02:49:49.782187
2017-11-16 02:49:49,782 [salt.state       ][INFO    ][24748] Executing state file.directory for /srv/glusterfs/keystone-credential-keys
2017-11-16 02:49:49,783 [salt.state       ][INFO    ][24748] {'/srv/glusterfs/keystone-credential-keys': 'New Dir'}
2017-11-16 02:49:49,783 [salt.state       ][INFO    ][24748] Completed state [/srv/glusterfs/keystone-credential-keys] at time 02:49:49.782818 duration_in_ms=0.631
2017-11-16 02:49:49,784 [salt.minion      ][INFO    ][24748] Returning information for job: 20171116024921173702
2017-11-16 02:49:51,524 [salt.minion      ][INFO    ][22407] User sudo_ubuntu Executing command test.ping with jid 20171116024951514119
2017-11-16 02:49:51,541 [salt.minion      ][INFO    ][29483] Starting a new job with PID 29483
2017-11-16 02:49:51,566 [salt.minion      ][INFO    ][29483] Returning information for job: 20171116024951514119
2017-11-16 02:49:51,705 [salt.minion      ][INFO    ][22407] User sudo_ubuntu Executing command state.sls with jid 20171116024951695229
2017-11-16 02:49:51,721 [salt.minion      ][INFO    ][29488] Starting a new job with PID 29488
2017-11-16 02:49:53,271 [salt.state       ][INFO    ][29488] Loading fresh modules for state activity
2017-11-16 02:49:53,294 [salt.fileclient  ][INFO    ][29488] Fetching file from saltenv 'base', ** done ** 'glusterfs/server/setup.sls'
2017-11-16 02:49:53,329 [salt.fileclient  ][INFO    ][29488] Fetching file from saltenv 'base', ** done ** 'glusterfs/map.jinja'
2017-11-16 02:49:53,393 [salt.fileclient  ][INFO    ][29488] Fetching file from saltenv 'base', ** done ** 'glusterfs/server/service.sls'
2017-11-16 02:49:53,412 [salt.fileclient  ][INFO    ][29488] Fetching file from saltenv 'base', ** done ** 'glusterfs/map.jinja'
2017-11-16 02:49:53,671 [salt.state       ][INFO    ][29488] Running state [attr] at time 02:49:53.670478
2017-11-16 02:49:53,671 [salt.state       ][INFO    ][29488] Executing state pkg.installed for attr
2017-11-16 02:49:53,671 [salt.loaded.int.module.cmdmod][INFO    ][29488] Executing command ['dpkg-query', '--showformat', '${Status} ${Package} ${Version} ${Architecture}\n', '-W'] in directory '/root'
2017-11-16 02:49:53,906 [salt.state       ][INFO    ][29488] Package attr is already installed
2017-11-16 02:49:53,906 [salt.state       ][INFO    ][29488] Completed state [attr] at time 02:49:53.905835 duration_in_ms=235.358
2017-11-16 02:49:53,906 [salt.state       ][INFO    ][29488] Running state [glusterfs-server] at time 02:49:53.906035
2017-11-16 02:49:53,906 [salt.state       ][INFO    ][29488] Executing state pkg.installed for glusterfs-server
2017-11-16 02:49:53,909 [salt.state       ][INFO    ][29488] Package glusterfs-server is already installed
2017-11-16 02:49:53,909 [salt.state       ][INFO    ][29488] Completed state [glusterfs-server] at time 02:49:53.908925 duration_in_ms=2.89
2017-11-16 02:49:53,909 [salt.state       ][INFO    ][29488] Running state [bc] at time 02:49:53.909061
2017-11-16 02:49:53,909 [salt.state       ][INFO    ][29488] Executing state pkg.installed for bc
2017-11-16 02:49:53,912 [salt.state       ][INFO    ][29488] Package bc is already installed
2017-11-16 02:49:53,912 [salt.state       ][INFO    ][29488] Completed state [bc] at time 02:49:53.911823 duration_in_ms=2.762
2017-11-16 02:49:53,913 [salt.state       ][INFO    ][29488] Running state [glusterfs-server] at time 02:49:53.912604
2017-11-16 02:49:53,913 [salt.state       ][INFO    ][29488] Executing state service.running for glusterfs-server
2017-11-16 02:49:53,913 [salt.loaded.int.module.cmdmod][INFO    ][29488] Executing command ['systemctl', 'status', 'glusterfs-server.service', '-n', '0'] in directory '/root'
2017-11-16 02:49:53,924 [salt.loaded.int.module.cmdmod][INFO    ][29488] Executing command ['systemctl', '--system', 'daemon-reload'] in directory '/root'
2017-11-16 02:49:53,968 [salt.loaded.int.module.cmdmod][INFO    ][29488] Executing command ['systemctl', 'status', 'glusterfs-server.service', '-n', '0'] in directory '/root'
2017-11-16 02:49:53,983 [salt.loaded.int.module.cmdmod][INFO    ][29488] Executing command ['systemctl', 'is-active', 'glusterfs-server.service'] in directory '/root'
2017-11-16 02:49:53,990 [salt.loaded.int.module.cmdmod][INFO    ][29488] Executing command ['systemctl', 'is-enabled', 'glusterfs-server.service'] in directory '/root'
2017-11-16 02:49:53,1000 [salt.state       ][INFO    ][29488] The service glusterfs-server is already running
2017-11-16 02:49:54,000 [salt.state       ][INFO    ][29488] Completed state [glusterfs-server] at time 02:49:54.000020 duration_in_ms=87.415
2017-11-16 02:49:54,001 [salt.state       ][INFO    ][29488] Running state [/etc/systemd/system/glusterfs-server.service.d/override.conf] at time 02:49:54.001306
2017-11-16 02:49:54,002 [salt.state       ][INFO    ][29488] Executing state file.managed for /etc/systemd/system/glusterfs-server.service.d/override.conf
2017-11-16 02:49:54,010 [salt.state       ][INFO    ][29488] File /etc/systemd/system/glusterfs-server.service.d/override.conf is in the correct state
2017-11-16 02:49:54,010 [salt.state       ][INFO    ][29488] Completed state [/etc/systemd/system/glusterfs-server.service.d/override.conf] at time 02:49:54.010273 duration_in_ms=8.968
2017-11-16 02:49:54,010 [salt.state       ][INFO    ][29488] Running state [/srv/glusterfs/glance] at time 02:49:54.010429
2017-11-16 02:49:54,011 [salt.state       ][INFO    ][29488] Executing state file.directory for /srv/glusterfs/glance
2017-11-16 02:49:54,011 [salt.state       ][INFO    ][29488] Directory /srv/glusterfs/glance is in the correct state
2017-11-16 02:49:54,011 [salt.state       ][INFO    ][29488] Completed state [/srv/glusterfs/glance] at time 02:49:54.011011 duration_in_ms=0.583
2017-11-16 02:49:54,011 [salt.state       ][INFO    ][29488] Running state [/srv/glusterfs/keystone-keys] at time 02:49:54.011145
2017-11-16 02:49:54,011 [salt.state       ][INFO    ][29488] Executing state file.directory for /srv/glusterfs/keystone-keys
2017-11-16 02:49:54,012 [salt.state       ][INFO    ][29488] Directory /srv/glusterfs/keystone-keys is in the correct state
2017-11-16 02:49:54,012 [salt.state       ][INFO    ][29488] Completed state [/srv/glusterfs/keystone-keys] at time 02:49:54.011702 duration_in_ms=0.557
2017-11-16 02:49:54,012 [salt.state       ][INFO    ][29488] Running state [/srv/glusterfs/nova_instances] at time 02:49:54.011847
2017-11-16 02:49:54,012 [salt.state       ][INFO    ][29488] Executing state file.directory for /srv/glusterfs/nova_instances
2017-11-16 02:49:54,012 [salt.state       ][INFO    ][29488] Directory /srv/glusterfs/nova_instances is in the correct state
2017-11-16 02:49:54,012 [salt.state       ][INFO    ][29488] Completed state [/srv/glusterfs/nova_instances] at time 02:49:54.012381 duration_in_ms=0.534
2017-11-16 02:49:54,013 [salt.state       ][INFO    ][29488] Running state [/srv/glusterfs/keystone-credential-keys] at time 02:49:54.012513
2017-11-16 02:49:54,013 [salt.state       ][INFO    ][29488] Executing state file.directory for /srv/glusterfs/keystone-credential-keys
2017-11-16 02:49:54,013 [salt.state       ][INFO    ][29488] Directory /srv/glusterfs/keystone-credential-keys is in the correct state
2017-11-16 02:49:54,013 [salt.state       ][INFO    ][29488] Completed state [/srv/glusterfs/keystone-credential-keys] at time 02:49:54.013037 duration_in_ms=0.524
2017-11-16 02:49:54,060 [salt.loaded.int.module.cmdmod][INFO    ][29488] Executing command ['git', '--version'] in directory '/root'
2017-11-16 02:49:54,149 [salt.state       ][INFO    ][29488] Running state [sleep 5] at time 02:49:54.148748
2017-11-16 02:49:54,149 [salt.state       ][INFO    ][29488] Executing state cmd.wait for sleep 5
2017-11-16 02:49:54,149 [salt.state       ][INFO    ][29488] No changes made for sleep 5
2017-11-16 02:49:54,149 [salt.state       ][INFO    ][29488] Completed state [sleep 5] at time 02:49:54.149449 duration_in_ms=0.701
2017-11-16 02:49:54,150 [salt.state       ][INFO    ][29488] Running state [10.167.4.141] at time 02:49:54.149899
2017-11-16 02:49:54,150 [salt.state       ][INFO    ][29488] Executing state glusterfs.peered for 10.167.4.141
2017-11-16 02:49:54,150 [salt.loaded.int.module.cmdmod][INFO    ][29488] Executing command 'gluster --version' in directory '/root'
2017-11-16 02:49:54,161 [salt.loaded.int.module.cmdmod][INFO    ][29488] Executing command 'gluster --xml --mode=script' in directory '/root'
2017-11-16 02:49:54,210 [salt.loaded.int.module.cmdmod][INFO    ][29488] Executing command 'gluster --version' in directory '/root'
2017-11-16 02:49:54,220 [salt.loaded.int.module.cmdmod][INFO    ][29488] Executing command 'gluster --xml --mode=script' in directory '/root'
2017-11-16 02:49:54,594 [salt.loaded.int.module.cmdmod][INFO    ][29488] Executing command 'gluster --version' in directory '/root'
2017-11-16 02:49:54,605 [salt.loaded.int.module.cmdmod][INFO    ][29488] Executing command 'gluster --xml --mode=script' in directory '/root'
2017-11-16 02:49:54,739 [salt.loaded.int.module.cmdmod][INFO    ][29488] Executing command 'gluster --version' in directory '/root'
2017-11-16 02:49:54,751 [salt.loaded.int.module.cmdmod][INFO    ][29488] Executing command 'gluster --xml --mode=script' in directory '/root'
2017-11-16 02:49:54,925 [salt.state       ][INFO    ][29488] {'new': {'10.167.4.141': []}, 'old': None}
2017-11-16 02:49:54,926 [salt.state       ][INFO    ][29488] Completed state [10.167.4.141] at time 02:49:54.925754 duration_in_ms=775.853
2017-11-16 02:49:54,928 [salt.state       ][INFO    ][29488] Running state [10.167.4.142] at time 02:49:54.928240
2017-11-16 02:49:54,929 [salt.state       ][INFO    ][29488] Executing state glusterfs.peered for 10.167.4.142
2017-11-16 02:49:54,929 [salt.loaded.int.module.cmdmod][INFO    ][29488] Executing command 'gluster --version' in directory '/root'
2017-11-16 02:49:54,941 [salt.loaded.int.module.cmdmod][INFO    ][29488] Executing command 'gluster --xml --mode=script' in directory '/root'
2017-11-16 02:49:54,992 [salt.loaded.int.module.cmdmod][INFO    ][29488] Executing command 'gluster --version' in directory '/root'
2017-11-16 02:49:55,001 [salt.loaded.int.module.cmdmod][INFO    ][29488] Executing command 'gluster --xml --mode=script' in directory '/root'
2017-11-16 02:49:55,053 [salt.loaded.int.module.cmdmod][INFO    ][29488] Executing command 'gluster --version' in directory '/root'
2017-11-16 02:49:55,062 [salt.loaded.int.module.cmdmod][INFO    ][29488] Executing command 'gluster --xml --mode=script' in directory '/root'
2017-11-16 02:49:55,112 [salt.loaded.int.module.cmdmod][INFO    ][29488] Executing command 'gluster --version' in directory '/root'
2017-11-16 02:49:55,122 [salt.loaded.int.module.cmdmod][INFO    ][29488] Executing command 'gluster --xml --mode=script' in directory '/root'
2017-11-16 02:49:55,169 [salt.state       ][INFO    ][29488] Peering with localhost is not needed
2017-11-16 02:49:55,169 [salt.state       ][INFO    ][29488] Completed state [10.167.4.142] at time 02:49:55.169241 duration_in_ms=241.001
2017-11-16 02:49:55,171 [salt.state       ][INFO    ][29488] Running state [10.167.4.143] at time 02:49:55.171455
2017-11-16 02:49:55,172 [salt.state       ][INFO    ][29488] Executing state glusterfs.peered for 10.167.4.143
2017-11-16 02:49:55,172 [salt.loaded.int.module.cmdmod][INFO    ][29488] Executing command 'gluster --version' in directory '/root'
2017-11-16 02:49:55,181 [salt.loaded.int.module.cmdmod][INFO    ][29488] Executing command 'gluster --xml --mode=script' in directory '/root'
2017-11-16 02:49:55,229 [salt.loaded.int.module.cmdmod][INFO    ][29488] Executing command 'gluster --version' in directory '/root'
2017-11-16 02:49:55,239 [salt.loaded.int.module.cmdmod][INFO    ][29488] Executing command 'gluster --xml --mode=script' in directory '/root'
2017-11-16 02:49:55,537 [salt.loaded.int.module.cmdmod][INFO    ][29488] Executing command 'gluster --version' in directory '/root'
2017-11-16 02:49:55,548 [salt.loaded.int.module.cmdmod][INFO    ][29488] Executing command 'gluster --xml --mode=script' in directory '/root'
2017-11-16 02:49:55,643 [salt.loaded.int.module.cmdmod][INFO    ][29488] Executing command 'gluster --version' in directory '/root'
2017-11-16 02:49:55,654 [salt.loaded.int.module.cmdmod][INFO    ][29488] Executing command 'gluster --xml --mode=script' in directory '/root'
2017-11-16 02:49:55,709 [salt.state       ][INFO    ][29488] {'new': {'10.167.4.141': [], '10.167.4.143': []}, 'old': {'10.167.4.141': []}}
2017-11-16 02:49:55,709 [salt.state       ][INFO    ][29488] Completed state [10.167.4.143] at time 02:49:55.708851 duration_in_ms=537.396
2017-11-16 02:49:55,710 [salt.state       ][INFO    ][29488] Running state [glance] at time 02:49:55.709657
2017-11-16 02:49:55,710 [salt.state       ][INFO    ][29488] Executing state glusterfs.created for glance
2017-11-16 02:49:55,710 [salt.loaded.int.module.cmdmod][INFO    ][29488] Executing command 'gluster --version' in directory '/root'
2017-11-16 02:49:55,719 [salt.loaded.int.module.cmdmod][INFO    ][29488] Executing command 'gluster --xml --mode=script' in directory '/root'
2017-11-16 02:49:55,838 [salt.loaded.int.module.cmdmod][INFO    ][29488] Executing command 'gluster --version' in directory '/root'
2017-11-16 02:49:55,849 [salt.loaded.int.module.cmdmod][INFO    ][29488] Executing command 'gluster --xml --mode=script' in directory '/root'
2017-11-16 02:49:56,686 [salt.loaded.int.module.cmdmod][INFO    ][29488] Executing command 'gluster --version' in directory '/root'
2017-11-16 02:49:56,699 [salt.loaded.int.module.cmdmod][INFO    ][29488] Executing command 'gluster --xml --mode=script' in directory '/root'
2017-11-16 02:49:57,913 [salt.loaded.int.module.cmdmod][INFO    ][29488] Executing command 'gluster --version' in directory '/root'
2017-11-16 02:49:57,926 [salt.loaded.int.module.cmdmod][INFO    ][29488] Executing command 'gluster --xml --mode=script' in directory '/root'
2017-11-16 02:49:57,982 [salt.state       ][INFO    ][29488] {'new': ['glance'], 'old': []}
2017-11-16 02:49:57,982 [salt.state       ][INFO    ][29488] Completed state [glance] at time 02:49:57.981905 duration_in_ms=2272.246
2017-11-16 02:49:57,985 [salt.state       ][INFO    ][29488] Running state [gluster volume set 'glance' 'diagnostics.brick-log-level' 'WARNING'] at time 02:49:57.985195
2017-11-16 02:49:57,986 [salt.state       ][INFO    ][29488] Executing state cmd.run for gluster volume set 'glance' 'diagnostics.brick-log-level' 'WARNING'
2017-11-16 02:49:57,986 [salt.loaded.int.module.cmdmod][INFO    ][29488] Executing command 'gluster volume info 'glance' | grep 'diagnostics.brick-log-level: WARNING'' in directory '/root'
2017-11-16 02:49:58,040 [salt.loaded.int.module.cmdmod][INFO    ][29488] Executing command 'gluster volume set 'glance' 'diagnostics.brick-log-level' 'WARNING'' in directory '/root'
2017-11-16 02:49:58,787 [salt.state       ][INFO    ][29488] {'pid': 29711, 'retcode': 0, 'stderr': '', 'stdout': 'volume set: success'}
2017-11-16 02:49:58,787 [salt.state       ][INFO    ][29488] Completed state [gluster volume set 'glance' 'diagnostics.brick-log-level' 'WARNING'] at time 02:49:58.787371 duration_in_ms=802.175
2017-11-16 02:49:58,788 [salt.state       ][INFO    ][29488] Running state [gluster volume set 'glance' 'network.remote-dio' 'True'] at time 02:49:58.787957
2017-11-16 02:49:58,788 [salt.state       ][INFO    ][29488] Executing state cmd.run for gluster volume set 'glance' 'network.remote-dio' 'True'
2017-11-16 02:49:58,789 [salt.loaded.int.module.cmdmod][INFO    ][29488] Executing command 'gluster volume info 'glance' | grep 'network.remote-dio: True'' in directory '/root'
2017-11-16 02:49:58,844 [salt.loaded.int.module.cmdmod][INFO    ][29488] Executing command 'gluster volume set 'glance' 'network.remote-dio' 'True'' in directory '/root'
2017-11-16 02:49:59,476 [salt.state       ][INFO    ][29488] {'pid': 29729, 'retcode': 0, 'stderr': '', 'stdout': 'volume set: success'}
2017-11-16 02:49:59,477 [salt.state       ][INFO    ][29488] Completed state [gluster volume set 'glance' 'network.remote-dio' 'True'] at time 02:49:59.476455 duration_in_ms=688.497
2017-11-16 02:49:59,477 [salt.state       ][INFO    ][29488] Running state [gluster volume set 'glance' 'nfs.disable' 'True'] at time 02:49:59.477090
2017-11-16 02:49:59,477 [salt.state       ][INFO    ][29488] Executing state cmd.run for gluster volume set 'glance' 'nfs.disable' 'True'
2017-11-16 02:49:59,478 [salt.loaded.int.module.cmdmod][INFO    ][29488] Executing command 'gluster volume info 'glance' | grep 'nfs.disable: True'' in directory '/root'
2017-11-16 02:49:59,533 [salt.loaded.int.module.cmdmod][INFO    ][29488] Executing command 'gluster volume set 'glance' 'nfs.disable' 'True'' in directory '/root'
2017-11-16 02:50:01,749 [salt.minion      ][INFO    ][22407] User sudo_ubuntu Executing command saltutil.find_job with jid 20171116025001738596
2017-11-16 02:50:01,766 [salt.minion      ][INFO    ][29756] Starting a new job with PID 29756
2017-11-16 02:50:01,777 [salt.minion      ][INFO    ][29756] Returning information for job: 20171116025001738596
2017-11-16 02:50:02,182 [salt.state       ][INFO    ][29488] {'pid': 29746, 'retcode': 0, 'stderr': '', 'stdout': 'volume set: success'}
2017-11-16 02:50:02,182 [salt.state       ][INFO    ][29488] Completed state [gluster volume set 'glance' 'nfs.disable' 'True'] at time 02:50:02.182375 duration_in_ms=2705.284
2017-11-16 02:50:02,183 [salt.state       ][INFO    ][29488] Running state [gluster volume set 'glance' 'diagnostics.client-log-level' 'WARNING'] at time 02:50:02.182901
2017-11-16 02:50:02,183 [salt.state       ][INFO    ][29488] Executing state cmd.run for gluster volume set 'glance' 'diagnostics.client-log-level' 'WARNING'
2017-11-16 02:50:02,184 [salt.loaded.int.module.cmdmod][INFO    ][29488] Executing command 'gluster volume info 'glance' | grep 'diagnostics.client-log-level: WARNING'' in directory '/root'
2017-11-16 02:50:02,241 [salt.loaded.int.module.cmdmod][INFO    ][29488] Executing command 'gluster volume set 'glance' 'diagnostics.client-log-level' 'WARNING'' in directory '/root'
2017-11-16 02:50:02,902 [salt.state       ][INFO    ][29488] {'pid': 29771, 'retcode': 0, 'stderr': '', 'stdout': 'volume set: success'}
2017-11-16 02:50:02,902 [salt.state       ][INFO    ][29488] Completed state [gluster volume set 'glance' 'diagnostics.client-log-level' 'WARNING'] at time 02:50:02.902269 duration_in_ms=719.368
2017-11-16 02:50:02,903 [salt.state       ][INFO    ][29488] Running state [gluster volume set 'glance' 'cluster.readdir-optimize' 'True'] at time 02:50:02.902813
2017-11-16 02:50:02,903 [salt.state       ][INFO    ][29488] Executing state cmd.run for gluster volume set 'glance' 'cluster.readdir-optimize' 'True'
2017-11-16 02:50:02,904 [salt.loaded.int.module.cmdmod][INFO    ][29488] Executing command 'gluster volume info 'glance' | grep 'cluster.readdir-optimize: True'' in directory '/root'
2017-11-16 02:50:02,962 [salt.loaded.int.module.cmdmod][INFO    ][29488] Executing command 'gluster volume set 'glance' 'cluster.readdir-optimize' 'True'' in directory '/root'
2017-11-16 02:50:03,646 [salt.state       ][INFO    ][29488] {'pid': 29789, 'retcode': 0, 'stderr': '', 'stdout': 'volume set: success'}
2017-11-16 02:50:03,646 [salt.state       ][INFO    ][29488] Completed state [gluster volume set 'glance' 'cluster.readdir-optimize' 'True'] at time 02:50:03.646146 duration_in_ms=743.344
2017-11-16 02:50:03,647 [salt.state       ][INFO    ][29488] Running state [glance] at time 02:50:03.647152
2017-11-16 02:50:03,647 [salt.state       ][INFO    ][29488] Executing state glusterfs.started for glance
2017-11-16 02:50:03,648 [salt.loaded.int.module.cmdmod][INFO    ][29488] Executing command 'gluster --version' in directory '/root'
2017-11-16 02:50:03,659 [salt.loaded.int.module.cmdmod][INFO    ][29488] Executing command 'gluster --xml --mode=script' in directory '/root'
2017-11-16 02:50:03,709 [salt.loaded.int.module.cmdmod][INFO    ][29488] Executing command 'gluster --version' in directory '/root'
2017-11-16 02:50:03,718 [salt.loaded.int.module.cmdmod][INFO    ][29488] Executing command 'gluster --xml --mode=script' in directory '/root'
2017-11-16 02:50:03,771 [salt.state       ][INFO    ][29488] Volume glance is already started
2017-11-16 02:50:03,771 [salt.state       ][INFO    ][29488] Completed state [glance] at time 02:50:03.771102 duration_in_ms=123.95
2017-11-16 02:50:03,772 [salt.state       ][INFO    ][29488] Running state [keystone-keys] at time 02:50:03.771921
2017-11-16 02:50:03,772 [salt.state       ][INFO    ][29488] Executing state glusterfs.created for keystone-keys
2017-11-16 02:50:03,773 [salt.loaded.int.module.cmdmod][INFO    ][29488] Executing command 'gluster --version' in directory '/root'
2017-11-16 02:50:03,782 [salt.loaded.int.module.cmdmod][INFO    ][29488] Executing command 'gluster --xml --mode=script' in directory '/root'
2017-11-16 02:50:03,832 [salt.loaded.int.module.cmdmod][INFO    ][29488] Executing command 'gluster --version' in directory '/root'
2017-11-16 02:50:03,841 [salt.loaded.int.module.cmdmod][INFO    ][29488] Executing command 'gluster --xml --mode=script' in directory '/root'
2017-11-16 02:50:04,611 [salt.loaded.int.module.cmdmod][INFO    ][29488] Executing command 'gluster --version' in directory '/root'
2017-11-16 02:50:04,624 [salt.loaded.int.module.cmdmod][INFO    ][29488] Executing command 'gluster --xml --mode=script' in directory '/root'
2017-11-16 02:50:07,433 [salt.loaded.int.module.cmdmod][INFO    ][29488] Executing command 'gluster --version' in directory '/root'
2017-11-16 02:50:07,448 [salt.loaded.int.module.cmdmod][INFO    ][29488] Executing command 'gluster --xml --mode=script' in directory '/root'
2017-11-16 02:50:07,505 [salt.state       ][INFO    ][29488] {'new': ['glance', 'keystone-keys'], 'old': ['glance']}
2017-11-16 02:50:07,506 [salt.state       ][INFO    ][29488] Completed state [keystone-keys] at time 02:50:07.505645 duration_in_ms=3733.723
2017-11-16 02:50:07,509 [salt.state       ][INFO    ][29488] Running state [gluster volume set 'keystone-keys' 'network.remote-dio' 'True'] at time 02:50:07.509121
2017-11-16 02:50:07,509 [salt.state       ][INFO    ][29488] Executing state cmd.run for gluster volume set 'keystone-keys' 'network.remote-dio' 'True'
2017-11-16 02:50:07,510 [salt.loaded.int.module.cmdmod][INFO    ][29488] Executing command 'gluster volume info 'keystone-keys' | grep 'network.remote-dio: True'' in directory '/root'
2017-11-16 02:50:07,562 [salt.loaded.int.module.cmdmod][INFO    ][29488] Executing command 'gluster volume set 'keystone-keys' 'network.remote-dio' 'True'' in directory '/root'
2017-11-16 02:50:08,215 [salt.state       ][INFO    ][29488] {'pid': 29900, 'retcode': 0, 'stderr': '', 'stdout': 'volume set: success'}
2017-11-16 02:50:08,216 [salt.state       ][INFO    ][29488] Completed state [gluster volume set 'keystone-keys' 'network.remote-dio' 'True'] at time 02:50:08.215751 duration_in_ms=706.629
2017-11-16 02:50:08,216 [salt.state       ][INFO    ][29488] Running state [gluster volume set 'keystone-keys' 'diagnostics.brick-log-level' 'WARNING'] at time 02:50:08.216310
2017-11-16 02:50:08,217 [salt.state       ][INFO    ][29488] Executing state cmd.run for gluster volume set 'keystone-keys' 'diagnostics.brick-log-level' 'WARNING'
2017-11-16 02:50:08,217 [salt.loaded.int.module.cmdmod][INFO    ][29488] Executing command 'gluster volume info 'keystone-keys' | grep 'diagnostics.brick-log-level: WARNING'' in directory '/root'
2017-11-16 02:50:08,274 [salt.loaded.int.module.cmdmod][INFO    ][29488] Executing command 'gluster volume set 'keystone-keys' 'diagnostics.brick-log-level' 'WARNING'' in directory '/root'
2017-11-16 02:50:09,060 [salt.state       ][INFO    ][29488] {'pid': 29917, 'retcode': 0, 'stderr': '', 'stdout': 'volume set: success'}
2017-11-16 02:50:09,061 [salt.state       ][INFO    ][29488] Completed state [gluster volume set 'keystone-keys' 'diagnostics.brick-log-level' 'WARNING'] at time 02:50:09.060758 duration_in_ms=844.447
2017-11-16 02:50:09,061 [salt.state       ][INFO    ][29488] Running state [gluster volume set 'keystone-keys' 'diagnostics.client-log-level' 'WARNING'] at time 02:50:09.061332
2017-11-16 02:50:09,062 [salt.state       ][INFO    ][29488] Executing state cmd.run for gluster volume set 'keystone-keys' 'diagnostics.client-log-level' 'WARNING'
2017-11-16 02:50:09,062 [salt.loaded.int.module.cmdmod][INFO    ][29488] Executing command 'gluster volume info 'keystone-keys' | grep 'diagnostics.client-log-level: WARNING'' in directory '/root'
2017-11-16 02:50:09,119 [salt.loaded.int.module.cmdmod][INFO    ][29488] Executing command 'gluster volume set 'keystone-keys' 'diagnostics.client-log-level' 'WARNING'' in directory '/root'
2017-11-16 02:50:09,744 [salt.state       ][INFO    ][29488] {'pid': 29936, 'retcode': 0, 'stderr': '', 'stdout': 'volume set: success'}
2017-11-16 02:50:09,745 [salt.state       ][INFO    ][29488] Completed state [gluster volume set 'keystone-keys' 'diagnostics.client-log-level' 'WARNING'] at time 02:50:09.744514 duration_in_ms=683.182
2017-11-16 02:50:09,745 [salt.state       ][INFO    ][29488] Running state [gluster volume set 'keystone-keys' 'nfs.disable' 'True'] at time 02:50:09.745192
2017-11-16 02:50:09,746 [salt.state       ][INFO    ][29488] Executing state cmd.run for gluster volume set 'keystone-keys' 'nfs.disable' 'True'
2017-11-16 02:50:09,746 [salt.loaded.int.module.cmdmod][INFO    ][29488] Executing command 'gluster volume info 'keystone-keys' | grep 'nfs.disable: True'' in directory '/root'
2017-11-16 02:50:09,805 [salt.loaded.int.module.cmdmod][INFO    ][29488] Executing command 'gluster volume set 'keystone-keys' 'nfs.disable' 'True'' in directory '/root'
2017-11-16 02:50:11,892 [salt.minion      ][INFO    ][22407] User sudo_ubuntu Executing command saltutil.find_job with jid 20171116025011882409
2017-11-16 02:50:11,908 [salt.minion      ][INFO    ][29965] Starting a new job with PID 29965
2017-11-16 02:50:11,920 [salt.minion      ][INFO    ][29965] Returning information for job: 20171116025011882409
2017-11-16 02:50:12,490 [salt.state       ][INFO    ][29488] {'pid': 29953, 'retcode': 0, 'stderr': '', 'stdout': 'volume set: success'}
2017-11-16 02:50:12,490 [salt.state       ][INFO    ][29488] Completed state [gluster volume set 'keystone-keys' 'nfs.disable' 'True'] at time 02:50:12.490080 duration_in_ms=2744.887
2017-11-16 02:50:12,491 [salt.state       ][INFO    ][29488] Running state [gluster volume set 'keystone-keys' 'cluster.readdir-optimize' 'True'] at time 02:50:12.490707
2017-11-16 02:50:12,491 [salt.state       ][INFO    ][29488] Executing state cmd.run for gluster volume set 'keystone-keys' 'cluster.readdir-optimize' 'True'
2017-11-16 02:50:12,492 [salt.loaded.int.module.cmdmod][INFO    ][29488] Executing command 'gluster volume info 'keystone-keys' | grep 'cluster.readdir-optimize: True'' in directory '/root'
2017-11-16 02:50:12,550 [salt.loaded.int.module.cmdmod][INFO    ][29488] Executing command 'gluster volume set 'keystone-keys' 'cluster.readdir-optimize' 'True'' in directory '/root'
2017-11-16 02:50:13,162 [salt.state       ][INFO    ][29488] {'pid': 29977, 'retcode': 0, 'stderr': '', 'stdout': 'volume set: success'}
2017-11-16 02:50:13,162 [salt.state       ][INFO    ][29488] Completed state [gluster volume set 'keystone-keys' 'cluster.readdir-optimize' 'True'] at time 02:50:13.161852 duration_in_ms=671.144
2017-11-16 02:50:13,163 [salt.state       ][INFO    ][29488] Running state [keystone-keys] at time 02:50:13.162894
2017-11-16 02:50:13,163 [salt.state       ][INFO    ][29488] Executing state glusterfs.started for keystone-keys
2017-11-16 02:50:13,164 [salt.loaded.int.module.cmdmod][INFO    ][29488] Executing command 'gluster --version' in directory '/root'
2017-11-16 02:50:13,176 [salt.loaded.int.module.cmdmod][INFO    ][29488] Executing command 'gluster --xml --mode=script' in directory '/root'
2017-11-16 02:50:13,229 [salt.loaded.int.module.cmdmod][INFO    ][29488] Executing command 'gluster --version' in directory '/root'
2017-11-16 02:50:13,239 [salt.loaded.int.module.cmdmod][INFO    ][29488] Executing command 'gluster --xml --mode=script' in directory '/root'
2017-11-16 02:50:13,296 [salt.state       ][INFO    ][29488] Volume keystone-keys is already started
2017-11-16 02:50:13,296 [salt.state       ][INFO    ][29488] Completed state [keystone-keys] at time 02:50:13.296170 duration_in_ms=133.275
2017-11-16 02:50:13,297 [salt.state       ][INFO    ][29488] Running state [nova_instances] at time 02:50:13.297001
2017-11-16 02:50:13,297 [salt.state       ][INFO    ][29488] Executing state glusterfs.created for nova_instances
2017-11-16 02:50:13,298 [salt.loaded.int.module.cmdmod][INFO    ][29488] Executing command 'gluster --version' in directory '/root'
2017-11-16 02:50:13,308 [salt.loaded.int.module.cmdmod][INFO    ][29488] Executing command 'gluster --xml --mode=script' in directory '/root'
2017-11-16 02:50:13,361 [salt.loaded.int.module.cmdmod][INFO    ][29488] Executing command 'gluster --version' in directory '/root'
2017-11-16 02:50:13,370 [salt.loaded.int.module.cmdmod][INFO    ][29488] Executing command 'gluster --xml --mode=script' in directory '/root'
2017-11-16 02:50:14,173 [salt.loaded.int.module.cmdmod][INFO    ][29488] Executing command 'gluster --version' in directory '/root'
2017-11-16 02:50:14,184 [salt.loaded.int.module.cmdmod][INFO    ][29488] Executing command 'gluster --xml --mode=script' in directory '/root'
2017-11-16 02:50:17,050 [salt.loaded.int.module.cmdmod][INFO    ][29488] Executing command 'gluster --version' in directory '/root'
2017-11-16 02:50:17,063 [salt.loaded.int.module.cmdmod][INFO    ][29488] Executing command 'gluster --xml --mode=script' in directory '/root'
2017-11-16 02:50:17,115 [salt.state       ][INFO    ][29488] {'new': ['glance', 'keystone-keys', 'nova_instances'], 'old': ['glance', 'keystone-keys']}
2017-11-16 02:50:17,115 [salt.state       ][INFO    ][29488] Completed state [nova_instances] at time 02:50:17.115091 duration_in_ms=3818.089
2017-11-16 02:50:17,119 [salt.state       ][INFO    ][29488] Running state [gluster volume set 'nova_instances' 'diagnostics.brick-log-level' 'WARNING'] at time 02:50:17.118757
2017-11-16 02:50:17,119 [salt.state       ][INFO    ][29488] Executing state cmd.run for gluster volume set 'nova_instances' 'diagnostics.brick-log-level' 'WARNING'
2017-11-16 02:50:17,120 [salt.loaded.int.module.cmdmod][INFO    ][29488] Executing command 'gluster volume info 'nova_instances' | grep 'diagnostics.brick-log-level: WARNING'' in directory '/root'
2017-11-16 02:50:17,176 [salt.loaded.int.module.cmdmod][INFO    ][29488] Executing command 'gluster volume set 'nova_instances' 'diagnostics.brick-log-level' 'WARNING'' in directory '/root'
2017-11-16 02:50:17,830 [salt.state       ][INFO    ][29488] {'pid': 30089, 'retcode': 0, 'stderr': '', 'stdout': 'volume set: success'}
2017-11-16 02:50:17,831 [salt.state       ][INFO    ][29488] Completed state [gluster volume set 'nova_instances' 'diagnostics.brick-log-level' 'WARNING'] at time 02:50:17.830493 duration_in_ms=711.734
2017-11-16 02:50:17,831 [salt.state       ][INFO    ][29488] Running state [gluster volume set 'nova_instances' 'cluster.readdir-optimize' 'On'] at time 02:50:17.831149
2017-11-16 02:50:17,832 [salt.state       ][INFO    ][29488] Executing state cmd.run for gluster volume set 'nova_instances' 'cluster.readdir-optimize' 'On'
2017-11-16 02:50:17,832 [salt.loaded.int.module.cmdmod][INFO    ][29488] Executing command 'gluster volume info 'nova_instances' | grep 'cluster.readdir-optimize: On'' in directory '/root'
2017-11-16 02:50:17,889 [salt.loaded.int.module.cmdmod][INFO    ][29488] Executing command 'gluster volume set 'nova_instances' 'cluster.readdir-optimize' 'On'' in directory '/root'
2017-11-16 02:50:18,559 [salt.state       ][INFO    ][29488] {'pid': 30108, 'retcode': 0, 'stderr': '', 'stdout': 'volume set: success'}
2017-11-16 02:50:18,559 [salt.state       ][INFO    ][29488] Completed state [gluster volume set 'nova_instances' 'cluster.readdir-optimize' 'On'] at time 02:50:18.558874 duration_in_ms=727.725
2017-11-16 02:50:18,560 [salt.state       ][INFO    ][29488] Running state [gluster volume set 'nova_instances' 'network.remote-dio' 'On'] at time 02:50:18.559514
2017-11-16 02:50:18,560 [salt.state       ][INFO    ][29488] Executing state cmd.run for gluster volume set 'nova_instances' 'network.remote-dio' 'On'
2017-11-16 02:50:18,561 [salt.loaded.int.module.cmdmod][INFO    ][29488] Executing command 'gluster volume info 'nova_instances' | grep 'network.remote-dio: On'' in directory '/root'
2017-11-16 02:50:18,621 [salt.loaded.int.module.cmdmod][INFO    ][29488] Executing command 'gluster volume set 'nova_instances' 'network.remote-dio' 'On'' in directory '/root'
2017-11-16 02:50:19,299 [salt.state       ][INFO    ][29488] {'pid': 30125, 'retcode': 0, 'stderr': '', 'stdout': 'volume set: success'}
2017-11-16 02:50:19,299 [salt.state       ][INFO    ][29488] Completed state [gluster volume set 'nova_instances' 'network.remote-dio' 'On'] at time 02:50:19.299058 duration_in_ms=739.543
2017-11-16 02:50:19,300 [salt.state       ][INFO    ][29488] Running state [gluster volume set 'nova_instances' 'nfs.disable' 'On'] at time 02:50:19.299636
2017-11-16 02:50:19,300 [salt.state       ][INFO    ][29488] Executing state cmd.run for gluster volume set 'nova_instances' 'nfs.disable' 'On'
2017-11-16 02:50:19,301 [salt.loaded.int.module.cmdmod][INFO    ][29488] Executing command 'gluster volume info 'nova_instances' | grep 'nfs.disable: On'' in directory '/root'
2017-11-16 02:50:19,355 [salt.loaded.int.module.cmdmod][INFO    ][29488] Executing command 'gluster volume set 'nova_instances' 'nfs.disable' 'On'' in directory '/root'
2017-11-16 02:50:22,035 [salt.minion      ][INFO    ][22407] User sudo_ubuntu Executing command saltutil.find_job with jid 20171116025022025131
2017-11-16 02:50:22,053 [salt.minion      ][INFO    ][30155] Starting a new job with PID 30155
2017-11-16 02:50:22,063 [salt.minion      ][INFO    ][30155] Returning information for job: 20171116025022025131
2017-11-16 02:50:22,064 [salt.state       ][INFO    ][29488] {'pid': 30142, 'retcode': 0, 'stderr': '', 'stdout': 'volume set: success'}
2017-11-16 02:50:22,064 [salt.state       ][INFO    ][29488] Completed state [gluster volume set 'nova_instances' 'nfs.disable' 'On'] at time 02:50:22.063911 duration_in_ms=2764.274
2017-11-16 02:50:22,065 [salt.state       ][INFO    ][29488] Running state [gluster volume set 'nova_instances' 'diagnostics.client-log-level' 'WARNING'] at time 02:50:22.064498
2017-11-16 02:50:22,065 [salt.state       ][INFO    ][29488] Executing state cmd.run for gluster volume set 'nova_instances' 'diagnostics.client-log-level' 'WARNING'
2017-11-16 02:50:22,065 [salt.loaded.int.module.cmdmod][INFO    ][29488] Executing command 'gluster volume info 'nova_instances' | grep 'diagnostics.client-log-level: WARNING'' in directory '/root'
2017-11-16 02:50:22,119 [salt.loaded.int.module.cmdmod][INFO    ][29488] Executing command 'gluster volume set 'nova_instances' 'diagnostics.client-log-level' 'WARNING'' in directory '/root'
2017-11-16 02:50:22,738 [salt.state       ][INFO    ][29488] {'pid': 30167, 'retcode': 0, 'stderr': '', 'stdout': 'volume set: success'}
2017-11-16 02:50:22,738 [salt.state       ][INFO    ][29488] Completed state [gluster volume set 'nova_instances' 'diagnostics.client-log-level' 'WARNING'] at time 02:50:22.738242 duration_in_ms=673.742
2017-11-16 02:50:22,739 [salt.state       ][INFO    ][29488] Running state [nova_instances] at time 02:50:22.739243
2017-11-16 02:50:22,740 [salt.state       ][INFO    ][29488] Executing state glusterfs.started for nova_instances
2017-11-16 02:50:22,740 [salt.loaded.int.module.cmdmod][INFO    ][29488] Executing command 'gluster --version' in directory '/root'
2017-11-16 02:50:22,751 [salt.loaded.int.module.cmdmod][INFO    ][29488] Executing command 'gluster --xml --mode=script' in directory '/root'
2017-11-16 02:50:22,804 [salt.loaded.int.module.cmdmod][INFO    ][29488] Executing command 'gluster --version' in directory '/root'
2017-11-16 02:50:22,814 [salt.loaded.int.module.cmdmod][INFO    ][29488] Executing command 'gluster --xml --mode=script' in directory '/root'
2017-11-16 02:50:22,869 [salt.state       ][INFO    ][29488] Volume nova_instances is already started
2017-11-16 02:50:22,869 [salt.state       ][INFO    ][29488] Completed state [nova_instances] at time 02:50:22.869281 duration_in_ms=130.037
2017-11-16 02:50:22,870 [salt.state       ][INFO    ][29488] Running state [keystone-credential-keys] at time 02:50:22.870251
2017-11-16 02:50:22,871 [salt.state       ][INFO    ][29488] Executing state glusterfs.created for keystone-credential-keys
2017-11-16 02:50:22,871 [salt.loaded.int.module.cmdmod][INFO    ][29488] Executing command 'gluster --version' in directory '/root'
2017-11-16 02:50:22,881 [salt.loaded.int.module.cmdmod][INFO    ][29488] Executing command 'gluster --xml --mode=script' in directory '/root'
2017-11-16 02:50:22,933 [salt.loaded.int.module.cmdmod][INFO    ][29488] Executing command 'gluster --version' in directory '/root'
2017-11-16 02:50:22,943 [salt.loaded.int.module.cmdmod][INFO    ][29488] Executing command 'gluster --xml --mode=script' in directory '/root'
2017-11-16 02:50:23,768 [salt.loaded.int.module.cmdmod][INFO    ][29488] Executing command 'gluster --version' in directory '/root'
2017-11-16 02:50:23,781 [salt.loaded.int.module.cmdmod][INFO    ][29488] Executing command 'gluster --xml --mode=script' in directory '/root'
2017-11-16 02:50:26,644 [salt.loaded.int.module.cmdmod][INFO    ][29488] Executing command 'gluster --version' in directory '/root'
2017-11-16 02:50:26,657 [salt.loaded.int.module.cmdmod][INFO    ][29488] Executing command 'gluster --xml --mode=script' in directory '/root'
2017-11-16 02:50:26,709 [salt.state       ][INFO    ][29488] {'new': ['glance', 'keystone-credential-keys', 'keystone-keys', 'nova_instances'], 'old': ['glance', 'keystone-keys', 'nova_instances']}
2017-11-16 02:50:26,709 [salt.state       ][INFO    ][29488] Completed state [keystone-credential-keys] at time 02:50:26.709362 duration_in_ms=3839.11
2017-11-16 02:50:26,712 [salt.state       ][INFO    ][29488] Running state [gluster volume set 'keystone-credential-keys' 'cluster.readdir-optimize' 'True'] at time 02:50:26.712390
2017-11-16 02:50:26,713 [salt.state       ][INFO    ][29488] Executing state cmd.run for gluster volume set 'keystone-credential-keys' 'cluster.readdir-optimize' 'True'
2017-11-16 02:50:26,713 [salt.loaded.int.module.cmdmod][INFO    ][29488] Executing command 'gluster volume info 'keystone-credential-keys' | grep 'cluster.readdir-optimize: True'' in directory '/root'
2017-11-16 02:50:26,764 [salt.loaded.int.module.cmdmod][INFO    ][29488] Executing command 'gluster volume set 'keystone-credential-keys' 'cluster.readdir-optimize' 'True'' in directory '/root'
2017-11-16 02:50:27,424 [salt.state       ][INFO    ][29488] {'pid': 30284, 'retcode': 0, 'stderr': '', 'stdout': 'volume set: success'}
2017-11-16 02:50:27,425 [salt.state       ][INFO    ][29488] Completed state [gluster volume set 'keystone-credential-keys' 'cluster.readdir-optimize' 'True'] at time 02:50:27.424773 duration_in_ms=712.382
2017-11-16 02:50:27,425 [salt.state       ][INFO    ][29488] Running state [gluster volume set 'keystone-credential-keys' 'diagnostics.brick-log-level' 'WARNING'] at time 02:50:27.425344
2017-11-16 02:50:27,426 [salt.state       ][INFO    ][29488] Executing state cmd.run for gluster volume set 'keystone-credential-keys' 'diagnostics.brick-log-level' 'WARNING'
2017-11-16 02:50:27,426 [salt.loaded.int.module.cmdmod][INFO    ][29488] Executing command 'gluster volume info 'keystone-credential-keys' | grep 'diagnostics.brick-log-level: WARNING'' in directory '/root'
2017-11-16 02:50:27,481 [salt.loaded.int.module.cmdmod][INFO    ][29488] Executing command 'gluster volume set 'keystone-credential-keys' 'diagnostics.brick-log-level' 'WARNING'' in directory '/root'
2017-11-16 02:50:28,175 [salt.state       ][INFO    ][29488] {'pid': 30301, 'retcode': 0, 'stderr': '', 'stdout': 'volume set: success'}
2017-11-16 02:50:28,175 [salt.state       ][INFO    ][29488] Completed state [gluster volume set 'keystone-credential-keys' 'diagnostics.brick-log-level' 'WARNING'] at time 02:50:28.174854 duration_in_ms=749.51
2017-11-16 02:50:28,175 [salt.state       ][INFO    ][29488] Running state [gluster volume set 'keystone-credential-keys' 'nfs.disable' 'True'] at time 02:50:28.175406
2017-11-16 02:50:28,176 [salt.state       ][INFO    ][29488] Executing state cmd.run for gluster volume set 'keystone-credential-keys' 'nfs.disable' 'True'
2017-11-16 02:50:28,176 [salt.loaded.int.module.cmdmod][INFO    ][29488] Executing command 'gluster volume info 'keystone-credential-keys' | grep 'nfs.disable: True'' in directory '/root'
2017-11-16 02:50:28,230 [salt.loaded.int.module.cmdmod][INFO    ][29488] Executing command 'gluster volume set 'keystone-credential-keys' 'nfs.disable' 'True'' in directory '/root'
2017-11-16 02:50:30,927 [salt.state       ][INFO    ][29488] {'pid': 30319, 'retcode': 0, 'stderr': '', 'stdout': 'volume set: success'}
2017-11-16 02:50:30,928 [salt.state       ][INFO    ][29488] Completed state [gluster volume set 'keystone-credential-keys' 'nfs.disable' 'True'] at time 02:50:30.927459 duration_in_ms=2752.052
2017-11-16 02:50:30,928 [salt.state       ][INFO    ][29488] Running state [gluster volume set 'keystone-credential-keys' 'diagnostics.client-log-level' 'WARNING'] at time 02:50:30.928054
2017-11-16 02:50:30,928 [salt.state       ][INFO    ][29488] Executing state cmd.run for gluster volume set 'keystone-credential-keys' 'diagnostics.client-log-level' 'WARNING'
2017-11-16 02:50:30,929 [salt.loaded.int.module.cmdmod][INFO    ][29488] Executing command 'gluster volume info 'keystone-credential-keys' | grep 'diagnostics.client-log-level: WARNING'' in directory '/root'
2017-11-16 02:50:30,985 [salt.loaded.int.module.cmdmod][INFO    ][29488] Executing command 'gluster volume set 'keystone-credential-keys' 'diagnostics.client-log-level' 'WARNING'' in directory '/root'
2017-11-16 02:50:31,599 [salt.state       ][INFO    ][29488] {'pid': 30339, 'retcode': 0, 'stderr': '', 'stdout': 'volume set: success'}
2017-11-16 02:50:31,599 [salt.state       ][INFO    ][29488] Completed state [gluster volume set 'keystone-credential-keys' 'diagnostics.client-log-level' 'WARNING'] at time 02:50:31.599182 duration_in_ms=671.126
2017-11-16 02:50:31,600 [salt.state       ][INFO    ][29488] Running state [gluster volume set 'keystone-credential-keys' 'network.remote-dio' 'True'] at time 02:50:31.599769
2017-11-16 02:50:31,600 [salt.state       ][INFO    ][29488] Executing state cmd.run for gluster volume set 'keystone-credential-keys' 'network.remote-dio' 'True'
2017-11-16 02:50:31,601 [salt.loaded.int.module.cmdmod][INFO    ][29488] Executing command 'gluster volume info 'keystone-credential-keys' | grep 'network.remote-dio: True'' in directory '/root'
2017-11-16 02:50:31,655 [salt.loaded.int.module.cmdmod][INFO    ][29488] Executing command 'gluster volume set 'keystone-credential-keys' 'network.remote-dio' 'True'' in directory '/root'
2017-11-16 02:50:32,176 [salt.minion      ][INFO    ][22407] User sudo_ubuntu Executing command saltutil.find_job with jid 20171116025032168564
2017-11-16 02:50:32,192 [salt.minion      ][INFO    ][30366] Starting a new job with PID 30366
2017-11-16 02:50:32,202 [salt.minion      ][INFO    ][30366] Returning information for job: 20171116025032168564
2017-11-16 02:50:32,323 [salt.state       ][INFO    ][29488] {'pid': 30356, 'retcode': 0, 'stderr': '', 'stdout': 'volume set: success'}
2017-11-16 02:50:32,323 [salt.state       ][INFO    ][29488] Completed state [gluster volume set 'keystone-credential-keys' 'network.remote-dio' 'True'] at time 02:50:32.323041 duration_in_ms=723.271
2017-11-16 02:50:32,324 [salt.state       ][INFO    ][29488] Running state [keystone-credential-keys] at time 02:50:32.324129
2017-11-16 02:50:32,324 [salt.state       ][INFO    ][29488] Executing state glusterfs.started for keystone-credential-keys
2017-11-16 02:50:32,325 [salt.loaded.int.module.cmdmod][INFO    ][29488] Executing command 'gluster --version' in directory '/root'
2017-11-16 02:50:32,338 [salt.loaded.int.module.cmdmod][INFO    ][29488] Executing command 'gluster --xml --mode=script' in directory '/root'
2017-11-16 02:50:32,391 [salt.loaded.int.module.cmdmod][INFO    ][29488] Executing command 'gluster --version' in directory '/root'
2017-11-16 02:50:32,400 [salt.loaded.int.module.cmdmod][INFO    ][29488] Executing command 'gluster --xml --mode=script' in directory '/root'
2017-11-16 02:50:32,454 [salt.state       ][INFO    ][29488] Volume keystone-credential-keys is already started
2017-11-16 02:50:32,454 [salt.state       ][INFO    ][29488] Completed state [keystone-credential-keys] at time 02:50:32.454240 duration_in_ms=130.11
2017-11-16 02:50:32,457 [salt.minion      ][INFO    ][29488] Returning information for job: 20171116024951695229
2017-11-16 02:50:42,785 [salt.minion      ][INFO    ][22407] User sudo_ubuntu Executing command test.ping with jid 20171116025042774134
2017-11-16 02:50:42,801 [salt.minion      ][INFO    ][30391] Starting a new job with PID 30391
2017-11-16 02:50:42,828 [salt.minion      ][INFO    ][30391] Returning information for job: 20171116025042774134
2017-11-16 02:50:42,958 [salt.minion      ][INFO    ][22407] User sudo_ubuntu Executing command cmd.run with jid 20171116025042948503
2017-11-16 02:50:42,973 [salt.minion      ][INFO    ][30396] Starting a new job with PID 30396
2017-11-16 02:50:42,977 [salt.loaded.int.module.cmdmod][INFO    ][30396] Executing command 'gluster peer status; gluster volume status' in directory '/root'
2017-11-16 02:50:43,090 [salt.minion      ][INFO    ][30396] Returning information for job: 20171116025042948503
2017-11-16 03:32:22,351 [salt.utils.schedule][INFO    ][22407] Running scheduled job: __mine_interval
2017-11-16 04:01:03,985 [salt.minion      ][INFO    ][22407] User sudo_ubuntu Executing command test.ping with jid 20171116040103975865
2017-11-16 04:01:04,009 [salt.minion      ][INFO    ][31365] Starting a new job with PID 31365
2017-11-16 04:01:04,035 [salt.minion      ][INFO    ][31365] Returning information for job: 20171116040103975865
2017-11-16 04:01:28,467 [salt.minion      ][INFO    ][22407] User sudo_ubuntu Executing command state.sls with jid 20171116040128456897
2017-11-16 04:01:28,482 [salt.minion      ][INFO    ][31370] Starting a new job with PID 31370
2017-11-16 04:01:28,923 [salt.state       ][INFO    ][31370] Loading fresh modules for state activity
2017-11-16 04:01:28,950 [salt.fileclient  ][INFO    ][31370] Fetching file from saltenv 'base', ** done ** 'keepalived/init.sls'
2017-11-16 04:01:28,969 [salt.fileclient  ][INFO    ][31370] Fetching file from saltenv 'base', ** done ** 'keepalived/cluster.sls'
2017-11-16 04:01:28,993 [salt.fileclient  ][INFO    ][31370] Fetching file from saltenv 'base', ** done ** 'keepalived/map.jinja'
2017-11-16 04:01:29,262 [salt.state       ][INFO    ][31370] Running state [lsof] at time 04:01:29.262144
2017-11-16 04:01:29,262 [salt.state       ][INFO    ][31370] Executing state pkg.installed for lsof
2017-11-16 04:01:29,263 [salt.loaded.int.module.cmdmod][INFO    ][31370] Executing command ['dpkg-query', '--showformat', '${Status} ${Package} ${Version} ${Architecture}\n', '-W'] in directory '/root'
2017-11-16 04:01:29,511 [salt.state       ][INFO    ][31370] Package lsof is already installed
2017-11-16 04:01:29,511 [salt.state       ][INFO    ][31370] Completed state [lsof] at time 04:01:29.511344 duration_in_ms=249.2
2017-11-16 04:01:29,512 [salt.state       ][INFO    ][31370] Running state [keepalived] at time 04:01:29.511545
2017-11-16 04:01:29,512 [salt.state       ][INFO    ][31370] Executing state pkg.installed for keepalived
2017-11-16 04:01:29,514 [salt.state       ][INFO    ][31370] Package keepalived is already installed
2017-11-16 04:01:29,514 [salt.state       ][INFO    ][31370] Completed state [keepalived] at time 04:01:29.514403 duration_in_ms=2.858
2017-11-16 04:01:29,516 [salt.state       ][INFO    ][31370] Running state [/etc/keepalived/keepalived.conf] at time 04:01:29.515709
2017-11-16 04:01:29,516 [salt.state       ][INFO    ][31370] Executing state file.managed for /etc/keepalived/keepalived.conf
2017-11-16 04:01:29,542 [salt.fileclient  ][INFO    ][31370] Fetching file from saltenv 'base', ** done ** 'keepalived/files/keepalived.conf'
2017-11-16 04:01:29,573 [salt.fileclient  ][INFO    ][31370] Fetching file from saltenv 'base', ** done ** 'keepalived/map.jinja'
2017-11-16 04:01:29,577 [salt.state       ][INFO    ][31370] File /etc/keepalived/keepalived.conf is in the correct state
2017-11-16 04:01:29,578 [salt.state       ][INFO    ][31370] Completed state [/etc/keepalived/keepalived.conf] at time 04:01:29.577543 duration_in_ms=61.834
2017-11-16 04:01:29,578 [salt.state       ][INFO    ][31370] Running state [keepalived] at time 04:01:29.578024
2017-11-16 04:01:29,578 [salt.state       ][INFO    ][31370] Executing state service.running for keepalived
2017-11-16 04:01:29,579 [salt.loaded.int.module.cmdmod][INFO    ][31370] Executing command ['systemctl', 'status', 'keepalived.service', '-n', '0'] in directory '/root'
2017-11-16 04:01:29,595 [salt.loaded.int.module.cmdmod][INFO    ][31370] Executing command ['systemctl', 'is-active', 'keepalived.service'] in directory '/root'
2017-11-16 04:01:29,603 [salt.loaded.int.module.cmdmod][INFO    ][31370] Executing command ['systemctl', 'is-enabled', 'keepalived.service'] in directory '/root'
2017-11-16 04:01:29,611 [salt.state       ][INFO    ][31370] The service keepalived is already running
2017-11-16 04:01:29,612 [salt.state       ][INFO    ][31370] Completed state [keepalived] at time 04:01:29.611689 duration_in_ms=33.664
2017-11-16 04:01:29,612 [salt.minion      ][INFO    ][31370] Returning information for job: 20171116040128456897
2017-11-16 04:01:35,919 [salt.minion      ][INFO    ][22407] User sudo_ubuntu Executing command pillar.get with jid 20171116040135910708
2017-11-16 04:01:35,941 [salt.minion      ][INFO    ][31395] Starting a new job with PID 31395
2017-11-16 04:01:35,944 [salt.minion      ][INFO    ][31395] Returning information for job: 20171116040135910708
2017-11-16 04:02:12,574 [salt.minion      ][INFO    ][22407] User sudo_ubuntu Executing command state.sls with jid 20171116040212564877
2017-11-16 04:02:12,590 [salt.minion      ][INFO    ][31400] Starting a new job with PID 31400
2017-11-16 04:02:13,031 [salt.state       ][INFO    ][31400] Loading fresh modules for state activity
2017-11-16 04:02:13,051 [salt.fileclient  ][INFO    ][31400] Fetching file from saltenv 'base', ** done ** 'glusterfs/server/service.sls'
2017-11-16 04:02:13,072 [salt.fileclient  ][INFO    ][31400] Fetching file from saltenv 'base', ** done ** 'glusterfs/map.jinja'
2017-11-16 04:02:13,345 [salt.state       ][INFO    ][31400] Running state [attr] at time 04:02:13.345443
2017-11-16 04:02:13,346 [salt.state       ][INFO    ][31400] Executing state pkg.installed for attr
2017-11-16 04:02:13,346 [salt.loaded.int.module.cmdmod][INFO    ][31400] Executing command ['dpkg-query', '--showformat', '${Status} ${Package} ${Version} ${Architecture}\n', '-W'] in directory '/root'
2017-11-16 04:02:13,589 [salt.state       ][INFO    ][31400] Package attr is already installed
2017-11-16 04:02:13,590 [salt.state       ][INFO    ][31400] Completed state [attr] at time 04:02:13.589470 duration_in_ms=244.026
2017-11-16 04:02:13,590 [salt.state       ][INFO    ][31400] Running state [glusterfs-server] at time 04:02:13.589672
2017-11-16 04:02:13,590 [salt.state       ][INFO    ][31400] Executing state pkg.installed for glusterfs-server
2017-11-16 04:02:13,592 [salt.state       ][INFO    ][31400] Package glusterfs-server is already installed
2017-11-16 04:02:13,593 [salt.state       ][INFO    ][31400] Completed state [glusterfs-server] at time 04:02:13.592517 duration_in_ms=2.845
2017-11-16 04:02:13,593 [salt.state       ][INFO    ][31400] Running state [bc] at time 04:02:13.592653
2017-11-16 04:02:13,593 [salt.state       ][INFO    ][31400] Executing state pkg.installed for bc
2017-11-16 04:02:13,595 [salt.state       ][INFO    ][31400] Package bc is already installed
2017-11-16 04:02:13,595 [salt.state       ][INFO    ][31400] Completed state [bc] at time 04:02:13.595386 duration_in_ms=2.733
2017-11-16 04:02:13,596 [salt.state       ][INFO    ][31400] Running state [glusterfs-server] at time 04:02:13.596069
2017-11-16 04:02:13,596 [salt.state       ][INFO    ][31400] Executing state service.running for glusterfs-server
2017-11-16 04:02:13,597 [salt.loaded.int.module.cmdmod][INFO    ][31400] Executing command ['systemctl', 'status', 'glusterfs-server.service', '-n', '0'] in directory '/root'
2017-11-16 04:02:13,615 [salt.loaded.int.module.cmdmod][INFO    ][31400] Executing command ['systemctl', 'is-active', 'glusterfs-server.service'] in directory '/root'
2017-11-16 04:02:13,623 [salt.loaded.int.module.cmdmod][INFO    ][31400] Executing command ['systemctl', 'is-enabled', 'glusterfs-server.service'] in directory '/root'
2017-11-16 04:02:13,633 [salt.state       ][INFO    ][31400] The service glusterfs-server is already running
2017-11-16 04:02:13,633 [salt.state       ][INFO    ][31400] Completed state [glusterfs-server] at time 04:02:13.633265 duration_in_ms=37.196
2017-11-16 04:02:13,635 [salt.state       ][INFO    ][31400] Running state [/etc/systemd/system/glusterfs-server.service.d/override.conf] at time 04:02:13.634730
2017-11-16 04:02:13,635 [salt.state       ][INFO    ][31400] Executing state file.managed for /etc/systemd/system/glusterfs-server.service.d/override.conf
2017-11-16 04:02:13,646 [salt.state       ][INFO    ][31400] File /etc/systemd/system/glusterfs-server.service.d/override.conf is in the correct state
2017-11-16 04:02:13,646 [salt.state       ][INFO    ][31400] Completed state [/etc/systemd/system/glusterfs-server.service.d/override.conf] at time 04:02:13.645837 duration_in_ms=11.108
2017-11-16 04:02:13,646 [salt.state       ][INFO    ][31400] Running state [/srv/glusterfs/glance] at time 04:02:13.646018
2017-11-16 04:02:13,646 [salt.state       ][INFO    ][31400] Executing state file.directory for /srv/glusterfs/glance
2017-11-16 04:02:13,647 [salt.state       ][INFO    ][31400] Directory /srv/glusterfs/glance is in the correct state
2017-11-16 04:02:13,647 [salt.state       ][INFO    ][31400] Completed state [/srv/glusterfs/glance] at time 04:02:13.646720 duration_in_ms=0.702
2017-11-16 04:02:13,647 [salt.state       ][INFO    ][31400] Running state [/srv/glusterfs/keystone-keys] at time 04:02:13.646896
2017-11-16 04:02:13,647 [salt.state       ][INFO    ][31400] Executing state file.directory for /srv/glusterfs/keystone-keys
2017-11-16 04:02:13,647 [salt.state       ][INFO    ][31400] Directory /srv/glusterfs/keystone-keys is in the correct state
2017-11-16 04:02:13,648 [salt.state       ][INFO    ][31400] Completed state [/srv/glusterfs/keystone-keys] at time 04:02:13.647607 duration_in_ms=0.71
2017-11-16 04:02:13,648 [salt.state       ][INFO    ][31400] Running state [/srv/glusterfs/nova_instances] at time 04:02:13.647770
2017-11-16 04:02:13,648 [salt.state       ][INFO    ][31400] Executing state file.directory for /srv/glusterfs/nova_instances
2017-11-16 04:02:13,648 [salt.state       ][INFO    ][31400] Directory /srv/glusterfs/nova_instances is in the correct state
2017-11-16 04:02:13,648 [salt.state       ][INFO    ][31400] Completed state [/srv/glusterfs/nova_instances] at time 04:02:13.648467 duration_in_ms=0.696
2017-11-16 04:02:13,649 [salt.state       ][INFO    ][31400] Running state [/srv/glusterfs/keystone-credential-keys] at time 04:02:13.648628
2017-11-16 04:02:13,649 [salt.state       ][INFO    ][31400] Executing state file.directory for /srv/glusterfs/keystone-credential-keys
2017-11-16 04:02:13,649 [salt.state       ][INFO    ][31400] Directory /srv/glusterfs/keystone-credential-keys is in the correct state
2017-11-16 04:02:13,649 [salt.state       ][INFO    ][31400] Completed state [/srv/glusterfs/keystone-credential-keys] at time 04:02:13.649292 duration_in_ms=0.663
2017-11-16 04:02:13,650 [salt.minion      ][INFO    ][31400] Returning information for job: 20171116040212564877
2017-11-16 04:02:14,836 [salt.minion      ][INFO    ][22407] User sudo_ubuntu Executing command test.ping with jid 20171116040214824486
2017-11-16 04:02:14,854 [salt.minion      ][INFO    ][31423] Starting a new job with PID 31423
2017-11-16 04:02:14,878 [salt.minion      ][INFO    ][31423] Returning information for job: 20171116040214824486
2017-11-16 04:02:15,013 [salt.minion      ][INFO    ][22407] User sudo_ubuntu Executing command state.sls with jid 20171116040215000801
2017-11-16 04:02:15,028 [salt.minion      ][INFO    ][31428] Starting a new job with PID 31428
2017-11-16 04:02:16,647 [salt.state       ][INFO    ][31428] Loading fresh modules for state activity
2017-11-16 04:02:16,668 [salt.fileclient  ][INFO    ][31428] Fetching file from saltenv 'base', ** done ** 'glusterfs/server/setup.sls'
2017-11-16 04:02:16,699 [salt.fileclient  ][INFO    ][31428] Fetching file from saltenv 'base', ** done ** 'glusterfs/map.jinja'
2017-11-16 04:02:16,762 [salt.fileclient  ][INFO    ][31428] Fetching file from saltenv 'base', ** done ** 'glusterfs/server/service.sls'
2017-11-16 04:02:16,780 [salt.fileclient  ][INFO    ][31428] Fetching file from saltenv 'base', ** done ** 'glusterfs/map.jinja'
2017-11-16 04:02:17,056 [salt.state       ][INFO    ][31428] Running state [attr] at time 04:02:17.055680
2017-11-16 04:02:17,056 [salt.state       ][INFO    ][31428] Executing state pkg.installed for attr
2017-11-16 04:02:17,056 [salt.loaded.int.module.cmdmod][INFO    ][31428] Executing command ['dpkg-query', '--showformat', '${Status} ${Package} ${Version} ${Architecture}\n', '-W'] in directory '/root'
2017-11-16 04:02:17,293 [salt.state       ][INFO    ][31428] Package attr is already installed
2017-11-16 04:02:17,294 [salt.state       ][INFO    ][31428] Completed state [attr] at time 04:02:17.293604 duration_in_ms=237.924
2017-11-16 04:02:17,294 [salt.state       ][INFO    ][31428] Running state [glusterfs-server] at time 04:02:17.293802
2017-11-16 04:02:17,294 [salt.state       ][INFO    ][31428] Executing state pkg.installed for glusterfs-server
2017-11-16 04:02:17,297 [salt.state       ][INFO    ][31428] Package glusterfs-server is already installed
2017-11-16 04:02:17,297 [salt.state       ][INFO    ][31428] Completed state [glusterfs-server] at time 04:02:17.296653 duration_in_ms=2.852
2017-11-16 04:02:17,297 [salt.state       ][INFO    ][31428] Running state [bc] at time 04:02:17.296793
2017-11-16 04:02:17,297 [salt.state       ][INFO    ][31428] Executing state pkg.installed for bc
2017-11-16 04:02:17,300 [salt.state       ][INFO    ][31428] Package bc is already installed
2017-11-16 04:02:17,300 [salt.state       ][INFO    ][31428] Completed state [bc] at time 04:02:17.299701 duration_in_ms=2.908
2017-11-16 04:02:17,300 [salt.state       ][INFO    ][31428] Running state [glusterfs-server] at time 04:02:17.300471
2017-11-16 04:02:17,301 [salt.state       ][INFO    ][31428] Executing state service.running for glusterfs-server
2017-11-16 04:02:17,301 [salt.loaded.int.module.cmdmod][INFO    ][31428] Executing command ['systemctl', 'status', 'glusterfs-server.service', '-n', '0'] in directory '/root'
2017-11-16 04:02:17,319 [salt.loaded.int.module.cmdmod][INFO    ][31428] Executing command ['systemctl', 'is-active', 'glusterfs-server.service'] in directory '/root'
2017-11-16 04:02:17,327 [salt.loaded.int.module.cmdmod][INFO    ][31428] Executing command ['systemctl', 'is-enabled', 'glusterfs-server.service'] in directory '/root'
2017-11-16 04:02:17,337 [salt.state       ][INFO    ][31428] The service glusterfs-server is already running
2017-11-16 04:02:17,337 [salt.state       ][INFO    ][31428] Completed state [glusterfs-server] at time 04:02:17.337010 duration_in_ms=36.539
2017-11-16 04:02:17,338 [salt.state       ][INFO    ][31428] Running state [/etc/systemd/system/glusterfs-server.service.d/override.conf] at time 04:02:17.338401
2017-11-16 04:02:17,339 [salt.state       ][INFO    ][31428] Executing state file.managed for /etc/systemd/system/glusterfs-server.service.d/override.conf
2017-11-16 04:02:17,347 [salt.state       ][INFO    ][31428] File /etc/systemd/system/glusterfs-server.service.d/override.conf is in the correct state
2017-11-16 04:02:17,347 [salt.state       ][INFO    ][31428] Completed state [/etc/systemd/system/glusterfs-server.service.d/override.conf] at time 04:02:17.347465 duration_in_ms=9.064
2017-11-16 04:02:17,348 [salt.state       ][INFO    ][31428] Running state [/srv/glusterfs/glance] at time 04:02:17.347622
2017-11-16 04:02:17,348 [salt.state       ][INFO    ][31428] Executing state file.directory for /srv/glusterfs/glance
2017-11-16 04:02:17,348 [salt.state       ][INFO    ][31428] Directory /srv/glusterfs/glance is in the correct state
2017-11-16 04:02:17,348 [salt.state       ][INFO    ][31428] Completed state [/srv/glusterfs/glance] at time 04:02:17.348265 duration_in_ms=0.643
2017-11-16 04:02:17,348 [salt.state       ][INFO    ][31428] Running state [/srv/glusterfs/keystone-keys] at time 04:02:17.348407
2017-11-16 04:02:17,349 [salt.state       ][INFO    ][31428] Executing state file.directory for /srv/glusterfs/keystone-keys
2017-11-16 04:02:17,349 [salt.state       ][INFO    ][31428] Directory /srv/glusterfs/keystone-keys is in the correct state
2017-11-16 04:02:17,349 [salt.state       ][INFO    ][31428] Completed state [/srv/glusterfs/keystone-keys] at time 04:02:17.348988 duration_in_ms=0.581
2017-11-16 04:02:17,349 [salt.state       ][INFO    ][31428] Running state [/srv/glusterfs/nova_instances] at time 04:02:17.349124
2017-11-16 04:02:17,349 [salt.state       ][INFO    ][31428] Executing state file.directory for /srv/glusterfs/nova_instances
2017-11-16 04:02:17,350 [salt.state       ][INFO    ][31428] Directory /srv/glusterfs/nova_instances is in the correct state
2017-11-16 04:02:17,350 [salt.state       ][INFO    ][31428] Completed state [/srv/glusterfs/nova_instances] at time 04:02:17.349704 duration_in_ms=0.58
2017-11-16 04:02:17,350 [salt.state       ][INFO    ][31428] Running state [/srv/glusterfs/keystone-credential-keys] at time 04:02:17.349849
2017-11-16 04:02:17,350 [salt.state       ][INFO    ][31428] Executing state file.directory for /srv/glusterfs/keystone-credential-keys
2017-11-16 04:02:17,350 [salt.state       ][INFO    ][31428] Directory /srv/glusterfs/keystone-credential-keys is in the correct state
2017-11-16 04:02:17,350 [salt.state       ][INFO    ][31428] Completed state [/srv/glusterfs/keystone-credential-keys] at time 04:02:17.350431 duration_in_ms=0.581
2017-11-16 04:02:17,385 [salt.loaded.int.module.cmdmod][INFO    ][31428] Executing command ['git', '--version'] in directory '/root'
2017-11-16 04:02:17,468 [salt.state       ][INFO    ][31428] Running state [sleep 5] at time 04:02:17.468170
2017-11-16 04:02:17,468 [salt.state       ][INFO    ][31428] Executing state cmd.wait for sleep 5
2017-11-16 04:02:17,469 [salt.state       ][INFO    ][31428] No changes made for sleep 5
2017-11-16 04:02:17,469 [salt.state       ][INFO    ][31428] Completed state [sleep 5] at time 04:02:17.468700 duration_in_ms=0.53
2017-11-16 04:02:17,469 [salt.state       ][INFO    ][31428] Running state [10.167.4.141] at time 04:02:17.469063
2017-11-16 04:02:17,469 [salt.state       ][INFO    ][31428] Executing state glusterfs.peered for 10.167.4.141
2017-11-16 04:02:17,470 [salt.loaded.int.module.cmdmod][INFO    ][31428] Executing command 'gluster --version' in directory '/root'
2017-11-16 04:02:17,479 [salt.loaded.int.module.cmdmod][INFO    ][31428] Executing command 'gluster --xml --mode=script' in directory '/root'
2017-11-16 04:02:17,525 [salt.state       ][INFO    ][31428] Host 10.167.4.141 already peered
2017-11-16 04:02:17,526 [salt.state       ][INFO    ][31428] Completed state [10.167.4.141] at time 04:02:17.525675 duration_in_ms=56.611
2017-11-16 04:02:17,528 [salt.state       ][INFO    ][31428] Running state [10.167.4.142] at time 04:02:17.527805
2017-11-16 04:02:17,528 [salt.state       ][INFO    ][31428] Executing state glusterfs.peered for 10.167.4.142
2017-11-16 04:02:17,528 [salt.loaded.int.module.cmdmod][INFO    ][31428] Executing command 'gluster --version' in directory '/root'
2017-11-16 04:02:17,537 [salt.loaded.int.module.cmdmod][INFO    ][31428] Executing command 'gluster --xml --mode=script' in directory '/root'
2017-11-16 04:02:17,585 [salt.loaded.int.module.cmdmod][INFO    ][31428] Executing command 'gluster --version' in directory '/root'
2017-11-16 04:02:17,594 [salt.loaded.int.module.cmdmod][INFO    ][31428] Executing command 'gluster --xml --mode=script' in directory '/root'
2017-11-16 04:02:17,643 [salt.loaded.int.module.cmdmod][INFO    ][31428] Executing command 'gluster --version' in directory '/root'
2017-11-16 04:02:17,652 [salt.loaded.int.module.cmdmod][INFO    ][31428] Executing command 'gluster --xml --mode=script' in directory '/root'
2017-11-16 04:02:17,699 [salt.loaded.int.module.cmdmod][INFO    ][31428] Executing command 'gluster --version' in directory '/root'
2017-11-16 04:02:17,708 [salt.loaded.int.module.cmdmod][INFO    ][31428] Executing command 'gluster --xml --mode=script' in directory '/root'
2017-11-16 04:02:17,757 [salt.state       ][INFO    ][31428] Peering with localhost is not needed
2017-11-16 04:02:17,757 [salt.state       ][INFO    ][31428] Completed state [10.167.4.142] at time 04:02:17.757149 duration_in_ms=229.342
2017-11-16 04:02:17,759 [salt.state       ][INFO    ][31428] Running state [10.167.4.143] at time 04:02:17.759259
2017-11-16 04:02:17,759 [salt.state       ][INFO    ][31428] Executing state glusterfs.peered for 10.167.4.143
2017-11-16 04:02:17,760 [salt.loaded.int.module.cmdmod][INFO    ][31428] Executing command 'gluster --version' in directory '/root'
2017-11-16 04:02:17,768 [salt.loaded.int.module.cmdmod][INFO    ][31428] Executing command 'gluster --xml --mode=script' in directory '/root'
2017-11-16 04:02:17,815 [salt.state       ][INFO    ][31428] Host 10.167.4.143 already peered
2017-11-16 04:02:17,815 [salt.state       ][INFO    ][31428] Completed state [10.167.4.143] at time 04:02:17.814724 duration_in_ms=55.465
2017-11-16 04:02:17,815 [salt.state       ][INFO    ][31428] Running state [glance] at time 04:02:17.815446
2017-11-16 04:02:17,816 [salt.state       ][INFO    ][31428] Executing state glusterfs.created for glance
2017-11-16 04:02:17,816 [salt.loaded.int.module.cmdmod][INFO    ][31428] Executing command 'gluster --version' in directory '/root'
2017-11-16 04:02:17,825 [salt.loaded.int.module.cmdmod][INFO    ][31428] Executing command 'gluster --xml --mode=script' in directory '/root'
2017-11-16 04:02:17,871 [salt.loaded.int.module.cmdmod][INFO    ][31428] Executing command 'gluster --version' in directory '/root'
2017-11-16 04:02:17,881 [salt.loaded.int.module.cmdmod][INFO    ][31428] Executing command 'gluster --xml --mode=script' in directory '/root'
2017-11-16 04:02:17,932 [salt.state       ][INFO    ][31428] Volume glance already exists and is started.
2017-11-16 04:02:17,932 [salt.state       ][INFO    ][31428] Completed state [glance] at time 04:02:17.931982 duration_in_ms=116.536
2017-11-16 04:02:17,935 [salt.state       ][INFO    ][31428] Running state [gluster volume set 'glance' 'diagnostics.brick-log-level' 'WARNING'] at time 04:02:17.934653
2017-11-16 04:02:17,935 [salt.state       ][INFO    ][31428] Executing state cmd.run for gluster volume set 'glance' 'diagnostics.brick-log-level' 'WARNING'
2017-11-16 04:02:17,935 [salt.loaded.int.module.cmdmod][INFO    ][31428] Executing command 'gluster volume info 'glance' | grep 'diagnostics.brick-log-level: WARNING'' in directory '/root'
2017-11-16 04:02:17,984 [salt.state       ][INFO    ][31428] unless execution succeeded
2017-11-16 04:02:17,984 [salt.state       ][INFO    ][31428] Completed state [gluster volume set 'glance' 'diagnostics.brick-log-level' 'WARNING'] at time 04:02:17.984245 duration_in_ms=49.591
2017-11-16 04:02:17,985 [salt.state       ][INFO    ][31428] Running state [gluster volume set 'glance' 'network.remote-dio' 'True'] at time 04:02:17.984678
2017-11-16 04:02:17,985 [salt.state       ][INFO    ][31428] Executing state cmd.run for gluster volume set 'glance' 'network.remote-dio' 'True'
2017-11-16 04:02:17,985 [salt.loaded.int.module.cmdmod][INFO    ][31428] Executing command 'gluster volume info 'glance' | grep 'network.remote-dio: True'' in directory '/root'
2017-11-16 04:02:18,033 [salt.state       ][INFO    ][31428] unless execution succeeded
2017-11-16 04:02:18,033 [salt.state       ][INFO    ][31428] Completed state [gluster volume set 'glance' 'network.remote-dio' 'True'] at time 04:02:18.032989 duration_in_ms=48.31
2017-11-16 04:02:18,033 [salt.state       ][INFO    ][31428] Running state [gluster volume set 'glance' 'nfs.disable' 'True'] at time 04:02:18.033423
2017-11-16 04:02:18,034 [salt.state       ][INFO    ][31428] Executing state cmd.run for gluster volume set 'glance' 'nfs.disable' 'True'
2017-11-16 04:02:18,034 [salt.loaded.int.module.cmdmod][INFO    ][31428] Executing command 'gluster volume info 'glance' | grep 'nfs.disable: True'' in directory '/root'
2017-11-16 04:02:18,083 [salt.state       ][INFO    ][31428] unless execution succeeded
2017-11-16 04:02:18,083 [salt.state       ][INFO    ][31428] Completed state [gluster volume set 'glance' 'nfs.disable' 'True'] at time 04:02:18.082721 duration_in_ms=49.297
2017-11-16 04:02:18,083 [salt.state       ][INFO    ][31428] Running state [gluster volume set 'glance' 'diagnostics.client-log-level' 'WARNING'] at time 04:02:18.083129
2017-11-16 04:02:18,083 [salt.state       ][INFO    ][31428] Executing state cmd.run for gluster volume set 'glance' 'diagnostics.client-log-level' 'WARNING'
2017-11-16 04:02:18,084 [salt.loaded.int.module.cmdmod][INFO    ][31428] Executing command 'gluster volume info 'glance' | grep 'diagnostics.client-log-level: WARNING'' in directory '/root'
2017-11-16 04:02:18,130 [salt.state       ][INFO    ][31428] unless execution succeeded
2017-11-16 04:02:18,130 [salt.state       ][INFO    ][31428] Completed state [gluster volume set 'glance' 'diagnostics.client-log-level' 'WARNING'] at time 04:02:18.130350 duration_in_ms=47.221
2017-11-16 04:02:18,131 [salt.state       ][INFO    ][31428] Running state [gluster volume set 'glance' 'cluster.readdir-optimize' 'True'] at time 04:02:18.130764
2017-11-16 04:02:18,131 [salt.state       ][INFO    ][31428] Executing state cmd.run for gluster volume set 'glance' 'cluster.readdir-optimize' 'True'
2017-11-16 04:02:18,131 [salt.loaded.int.module.cmdmod][INFO    ][31428] Executing command 'gluster volume info 'glance' | grep 'cluster.readdir-optimize: True'' in directory '/root'
2017-11-16 04:02:18,180 [salt.state       ][INFO    ][31428] unless execution succeeded
2017-11-16 04:02:18,180 [salt.state       ][INFO    ][31428] Completed state [gluster volume set 'glance' 'cluster.readdir-optimize' 'True'] at time 04:02:18.179929 duration_in_ms=49.164
2017-11-16 04:02:18,181 [salt.state       ][INFO    ][31428] Running state [glance] at time 04:02:18.180832
2017-11-16 04:02:18,181 [salt.state       ][INFO    ][31428] Executing state glusterfs.started for glance
2017-11-16 04:02:18,181 [salt.loaded.int.module.cmdmod][INFO    ][31428] Executing command 'gluster --version' in directory '/root'
2017-11-16 04:02:18,189 [salt.loaded.int.module.cmdmod][INFO    ][31428] Executing command 'gluster --xml --mode=script' in directory '/root'
2017-11-16 04:02:18,236 [salt.loaded.int.module.cmdmod][INFO    ][31428] Executing command 'gluster --version' in directory '/root'
2017-11-16 04:02:18,246 [salt.loaded.int.module.cmdmod][INFO    ][31428] Executing command 'gluster --xml --mode=script' in directory '/root'
2017-11-16 04:02:18,296 [salt.state       ][INFO    ][31428] Volume glance is already started
2017-11-16 04:02:18,297 [salt.state       ][INFO    ][31428] Completed state [glance] at time 04:02:18.296616 duration_in_ms=115.784
2017-11-16 04:02:18,297 [salt.state       ][INFO    ][31428] Running state [keystone-keys] at time 04:02:18.297336
2017-11-16 04:02:18,298 [salt.state       ][INFO    ][31428] Executing state glusterfs.created for keystone-keys
2017-11-16 04:02:18,298 [salt.loaded.int.module.cmdmod][INFO    ][31428] Executing command 'gluster --version' in directory '/root'
2017-11-16 04:02:18,306 [salt.loaded.int.module.cmdmod][INFO    ][31428] Executing command 'gluster --xml --mode=script' in directory '/root'
2017-11-16 04:02:18,353 [salt.loaded.int.module.cmdmod][INFO    ][31428] Executing command 'gluster --version' in directory '/root'
2017-11-16 04:02:18,362 [salt.loaded.int.module.cmdmod][INFO    ][31428] Executing command 'gluster --xml --mode=script' in directory '/root'
2017-11-16 04:02:18,413 [salt.state       ][INFO    ][31428] Volume keystone-keys already exists and is started.
2017-11-16 04:02:18,414 [salt.state       ][INFO    ][31428] Completed state [keystone-keys] at time 04:02:18.413500 duration_in_ms=116.164
2017-11-16 04:02:18,416 [salt.state       ][INFO    ][31428] Running state [gluster volume set 'keystone-keys' 'network.remote-dio' 'True'] at time 04:02:18.416178
2017-11-16 04:02:18,416 [salt.state       ][INFO    ][31428] Executing state cmd.run for gluster volume set 'keystone-keys' 'network.remote-dio' 'True'
2017-11-16 04:02:18,417 [salt.loaded.int.module.cmdmod][INFO    ][31428] Executing command 'gluster volume info 'keystone-keys' | grep 'network.remote-dio: True'' in directory '/root'
2017-11-16 04:02:18,464 [salt.state       ][INFO    ][31428] unless execution succeeded
2017-11-16 04:02:18,464 [salt.state       ][INFO    ][31428] Completed state [gluster volume set 'keystone-keys' 'network.remote-dio' 'True'] at time 04:02:18.464176 duration_in_ms=47.998
2017-11-16 04:02:18,465 [salt.state       ][INFO    ][31428] Running state [gluster volume set 'keystone-keys' 'diagnostics.brick-log-level' 'WARNING'] at time 04:02:18.464593
2017-11-16 04:02:18,465 [salt.state       ][INFO    ][31428] Executing state cmd.run for gluster volume set 'keystone-keys' 'diagnostics.brick-log-level' 'WARNING'
2017-11-16 04:02:18,465 [salt.loaded.int.module.cmdmod][INFO    ][31428] Executing command 'gluster volume info 'keystone-keys' | grep 'diagnostics.brick-log-level: WARNING'' in directory '/root'
2017-11-16 04:02:18,513 [salt.state       ][INFO    ][31428] unless execution succeeded
2017-11-16 04:02:18,514 [salt.state       ][INFO    ][31428] Completed state [gluster volume set 'keystone-keys' 'diagnostics.brick-log-level' 'WARNING'] at time 04:02:18.513465 duration_in_ms=48.871
2017-11-16 04:02:18,514 [salt.state       ][INFO    ][31428] Running state [gluster volume set 'keystone-keys' 'diagnostics.client-log-level' 'WARNING'] at time 04:02:18.513918
2017-11-16 04:02:18,514 [salt.state       ][INFO    ][31428] Executing state cmd.run for gluster volume set 'keystone-keys' 'diagnostics.client-log-level' 'WARNING'
2017-11-16 04:02:18,515 [salt.loaded.int.module.cmdmod][INFO    ][31428] Executing command 'gluster volume info 'keystone-keys' | grep 'diagnostics.client-log-level: WARNING'' in directory '/root'
2017-11-16 04:02:18,564 [salt.state       ][INFO    ][31428] unless execution succeeded
2017-11-16 04:02:18,564 [salt.state       ][INFO    ][31428] Completed state [gluster volume set 'keystone-keys' 'diagnostics.client-log-level' 'WARNING'] at time 04:02:18.564319 duration_in_ms=50.4
2017-11-16 04:02:18,565 [salt.state       ][INFO    ][31428] Running state [gluster volume set 'keystone-keys' 'nfs.disable' 'True'] at time 04:02:18.564712
2017-11-16 04:02:18,565 [salt.state       ][INFO    ][31428] Executing state cmd.run for gluster volume set 'keystone-keys' 'nfs.disable' 'True'
2017-11-16 04:02:18,565 [salt.loaded.int.module.cmdmod][INFO    ][31428] Executing command 'gluster volume info 'keystone-keys' | grep 'nfs.disable: True'' in directory '/root'
2017-11-16 04:02:18,612 [salt.state       ][INFO    ][31428] unless execution succeeded
2017-11-16 04:02:18,613 [salt.state       ][INFO    ][31428] Completed state [gluster volume set 'keystone-keys' 'nfs.disable' 'True'] at time 04:02:18.612626 duration_in_ms=47.913
2017-11-16 04:02:18,613 [salt.state       ][INFO    ][31428] Running state [gluster volume set 'keystone-keys' 'cluster.readdir-optimize' 'True'] at time 04:02:18.613036
2017-11-16 04:02:18,613 [salt.state       ][INFO    ][31428] Executing state cmd.run for gluster volume set 'keystone-keys' 'cluster.readdir-optimize' 'True'
2017-11-16 04:02:18,614 [salt.loaded.int.module.cmdmod][INFO    ][31428] Executing command 'gluster volume info 'keystone-keys' | grep 'cluster.readdir-optimize: True'' in directory '/root'
2017-11-16 04:02:18,661 [salt.state       ][INFO    ][31428] unless execution succeeded
2017-11-16 04:02:18,661 [salt.state       ][INFO    ][31428] Completed state [gluster volume set 'keystone-keys' 'cluster.readdir-optimize' 'True'] at time 04:02:18.660913 duration_in_ms=47.877
2017-11-16 04:02:18,662 [salt.state       ][INFO    ][31428] Running state [keystone-keys] at time 04:02:18.661801
2017-11-16 04:02:18,662 [salt.state       ][INFO    ][31428] Executing state glusterfs.started for keystone-keys
2017-11-16 04:02:18,662 [salt.loaded.int.module.cmdmod][INFO    ][31428] Executing command 'gluster --version' in directory '/root'
2017-11-16 04:02:18,671 [salt.loaded.int.module.cmdmod][INFO    ][31428] Executing command 'gluster --xml --mode=script' in directory '/root'
2017-11-16 04:02:18,719 [salt.loaded.int.module.cmdmod][INFO    ][31428] Executing command 'gluster --version' in directory '/root'
2017-11-16 04:02:18,727 [salt.loaded.int.module.cmdmod][INFO    ][31428] Executing command 'gluster --xml --mode=script' in directory '/root'
2017-11-16 04:02:18,778 [salt.state       ][INFO    ][31428] Volume keystone-keys is already started
2017-11-16 04:02:18,778 [salt.state       ][INFO    ][31428] Completed state [keystone-keys] at time 04:02:18.778223 duration_in_ms=116.421
2017-11-16 04:02:18,779 [salt.state       ][INFO    ][31428] Running state [nova_instances] at time 04:02:18.778969
2017-11-16 04:02:18,779 [salt.state       ][INFO    ][31428] Executing state glusterfs.created for nova_instances
2017-11-16 04:02:18,780 [salt.loaded.int.module.cmdmod][INFO    ][31428] Executing command 'gluster --version' in directory '/root'
2017-11-16 04:02:18,788 [salt.loaded.int.module.cmdmod][INFO    ][31428] Executing command 'gluster --xml --mode=script' in directory '/root'
2017-11-16 04:02:18,835 [salt.loaded.int.module.cmdmod][INFO    ][31428] Executing command 'gluster --version' in directory '/root'
2017-11-16 04:02:18,844 [salt.loaded.int.module.cmdmod][INFO    ][31428] Executing command 'gluster --xml --mode=script' in directory '/root'
2017-11-16 04:02:18,895 [salt.state       ][INFO    ][31428] Volume nova_instances already exists and is started.
2017-11-16 04:02:18,896 [salt.state       ][INFO    ][31428] Completed state [nova_instances] at time 04:02:18.895556 duration_in_ms=116.585
2017-11-16 04:02:18,898 [salt.state       ][INFO    ][31428] Running state [gluster volume set 'nova_instances' 'diagnostics.brick-log-level' 'WARNING'] at time 04:02:18.898458
2017-11-16 04:02:18,899 [salt.state       ][INFO    ][31428] Executing state cmd.run for gluster volume set 'nova_instances' 'diagnostics.brick-log-level' 'WARNING'
2017-11-16 04:02:18,899 [salt.loaded.int.module.cmdmod][INFO    ][31428] Executing command 'gluster volume info 'nova_instances' | grep 'diagnostics.brick-log-level: WARNING'' in directory '/root'
2017-11-16 04:02:18,949 [salt.state       ][INFO    ][31428] unless execution succeeded
2017-11-16 04:02:18,949 [salt.state       ][INFO    ][31428] Completed state [gluster volume set 'nova_instances' 'diagnostics.brick-log-level' 'WARNING'] at time 04:02:18.948913 duration_in_ms=50.455
2017-11-16 04:02:18,949 [salt.state       ][INFO    ][31428] Running state [gluster volume set 'nova_instances' 'cluster.readdir-optimize' 'On'] at time 04:02:18.949347
2017-11-16 04:02:18,950 [salt.state       ][INFO    ][31428] Executing state cmd.run for gluster volume set 'nova_instances' 'cluster.readdir-optimize' 'On'
2017-11-16 04:02:18,950 [salt.loaded.int.module.cmdmod][INFO    ][31428] Executing command 'gluster volume info 'nova_instances' | grep 'cluster.readdir-optimize: On'' in directory '/root'
2017-11-16 04:02:18,999 [salt.state       ][INFO    ][31428] unless execution succeeded
2017-11-16 04:02:18,999 [salt.state       ][INFO    ][31428] Completed state [gluster volume set 'nova_instances' 'cluster.readdir-optimize' 'On'] at time 04:02:18.998881 duration_in_ms=49.533
2017-11-16 04:02:18,999 [salt.state       ][INFO    ][31428] Running state [gluster volume set 'nova_instances' 'network.remote-dio' 'On'] at time 04:02:18.999327
2017-11-16 04:02:18,1000 [salt.state       ][INFO    ][31428] Executing state cmd.run for gluster volume set 'nova_instances' 'network.remote-dio' 'On'
2017-11-16 04:02:19,000 [salt.loaded.int.module.cmdmod][INFO    ][31428] Executing command 'gluster volume info 'nova_instances' | grep 'network.remote-dio: On'' in directory '/root'
2017-11-16 04:02:19,047 [salt.state       ][INFO    ][31428] unless execution succeeded
2017-11-16 04:02:19,047 [salt.state       ][INFO    ][31428] Completed state [gluster volume set 'nova_instances' 'network.remote-dio' 'On'] at time 04:02:19.046973 duration_in_ms=47.646
2017-11-16 04:02:19,047 [salt.state       ][INFO    ][31428] Running state [gluster volume set 'nova_instances' 'nfs.disable' 'On'] at time 04:02:19.047439
2017-11-16 04:02:19,048 [salt.state       ][INFO    ][31428] Executing state cmd.run for gluster volume set 'nova_instances' 'nfs.disable' 'On'
2017-11-16 04:02:19,048 [salt.loaded.int.module.cmdmod][INFO    ][31428] Executing command 'gluster volume info 'nova_instances' | grep 'nfs.disable: On'' in directory '/root'
2017-11-16 04:02:19,099 [salt.state       ][INFO    ][31428] unless execution succeeded
2017-11-16 04:02:19,099 [salt.state       ][INFO    ][31428] Completed state [gluster volume set 'nova_instances' 'nfs.disable' 'On'] at time 04:02:19.098728 duration_in_ms=51.287
2017-11-16 04:02:19,099 [salt.state       ][INFO    ][31428] Running state [gluster volume set 'nova_instances' 'diagnostics.client-log-level' 'WARNING'] at time 04:02:19.099199
2017-11-16 04:02:19,099 [salt.state       ][INFO    ][31428] Executing state cmd.run for gluster volume set 'nova_instances' 'diagnostics.client-log-level' 'WARNING'
2017-11-16 04:02:19,100 [salt.loaded.int.module.cmdmod][INFO    ][31428] Executing command 'gluster volume info 'nova_instances' | grep 'diagnostics.client-log-level: WARNING'' in directory '/root'
2017-11-16 04:02:19,149 [salt.state       ][INFO    ][31428] unless execution succeeded
2017-11-16 04:02:19,149 [salt.state       ][INFO    ][31428] Completed state [gluster volume set 'nova_instances' 'diagnostics.client-log-level' 'WARNING'] at time 04:02:19.149083 duration_in_ms=49.882
2017-11-16 04:02:19,150 [salt.state       ][INFO    ][31428] Running state [nova_instances] at time 04:02:19.149973
2017-11-16 04:02:19,150 [salt.state       ][INFO    ][31428] Executing state glusterfs.started for nova_instances
2017-11-16 04:02:19,151 [salt.loaded.int.module.cmdmod][INFO    ][31428] Executing command 'gluster --version' in directory '/root'
2017-11-16 04:02:19,160 [salt.loaded.int.module.cmdmod][INFO    ][31428] Executing command 'gluster --xml --mode=script' in directory '/root'
2017-11-16 04:02:19,207 [salt.loaded.int.module.cmdmod][INFO    ][31428] Executing command 'gluster --version' in directory '/root'
2017-11-16 04:02:19,216 [salt.loaded.int.module.cmdmod][INFO    ][31428] Executing command 'gluster --xml --mode=script' in directory '/root'
2017-11-16 04:02:19,268 [salt.state       ][INFO    ][31428] Volume nova_instances is already started
2017-11-16 04:02:19,268 [salt.state       ][INFO    ][31428] Completed state [nova_instances] at time 04:02:19.268308 duration_in_ms=118.334
2017-11-16 04:02:19,269 [salt.state       ][INFO    ][31428] Running state [keystone-credential-keys] at time 04:02:19.269138
2017-11-16 04:02:19,269 [salt.state       ][INFO    ][31428] Executing state glusterfs.created for keystone-credential-keys
2017-11-16 04:02:19,270 [salt.loaded.int.module.cmdmod][INFO    ][31428] Executing command 'gluster --version' in directory '/root'
2017-11-16 04:02:19,279 [salt.loaded.int.module.cmdmod][INFO    ][31428] Executing command 'gluster --xml --mode=script' in directory '/root'
2017-11-16 04:02:19,329 [salt.loaded.int.module.cmdmod][INFO    ][31428] Executing command 'gluster --version' in directory '/root'
2017-11-16 04:02:19,338 [salt.loaded.int.module.cmdmod][INFO    ][31428] Executing command 'gluster --xml --mode=script' in directory '/root'
2017-11-16 04:02:19,392 [salt.state       ][INFO    ][31428] Volume keystone-credential-keys already exists and is started.
2017-11-16 04:02:19,392 [salt.state       ][INFO    ][31428] Completed state [keystone-credential-keys] at time 04:02:19.391740 duration_in_ms=122.601
2017-11-16 04:02:19,395 [salt.state       ][INFO    ][31428] Running state [gluster volume set 'keystone-credential-keys' 'cluster.readdir-optimize' 'True'] at time 04:02:19.394622
2017-11-16 04:02:19,395 [salt.state       ][INFO    ][31428] Executing state cmd.run for gluster volume set 'keystone-credential-keys' 'cluster.readdir-optimize' 'True'
2017-11-16 04:02:19,395 [salt.loaded.int.module.cmdmod][INFO    ][31428] Executing command 'gluster volume info 'keystone-credential-keys' | grep 'cluster.readdir-optimize: True'' in directory '/root'
2017-11-16 04:02:19,443 [salt.state       ][INFO    ][31428] unless execution succeeded
2017-11-16 04:02:19,444 [salt.state       ][INFO    ][31428] Completed state [gluster volume set 'keystone-credential-keys' 'cluster.readdir-optimize' 'True'] at time 04:02:19.443472 duration_in_ms=48.849
2017-11-16 04:02:19,444 [salt.state       ][INFO    ][31428] Running state [gluster volume set 'keystone-credential-keys' 'diagnostics.brick-log-level' 'WARNING'] at time 04:02:19.443929
2017-11-16 04:02:19,444 [salt.state       ][INFO    ][31428] Executing state cmd.run for gluster volume set 'keystone-credential-keys' 'diagnostics.brick-log-level' 'WARNING'
2017-11-16 04:02:19,445 [salt.loaded.int.module.cmdmod][INFO    ][31428] Executing command 'gluster volume info 'keystone-credential-keys' | grep 'diagnostics.brick-log-level: WARNING'' in directory '/root'
2017-11-16 04:02:19,491 [salt.state       ][INFO    ][31428] unless execution succeeded
2017-11-16 04:02:19,491 [salt.state       ][INFO    ][31428] Completed state [gluster volume set 'keystone-credential-keys' 'diagnostics.brick-log-level' 'WARNING'] at time 04:02:19.491291 duration_in_ms=47.361
2017-11-16 04:02:19,493 [salt.state       ][INFO    ][31428] Running state [gluster volume set 'keystone-credential-keys' 'nfs.disable' 'True'] at time 04:02:19.493229
2017-11-16 04:02:19,494 [salt.state       ][INFO    ][31428] Executing state cmd.run for gluster volume set 'keystone-credential-keys' 'nfs.disable' 'True'
2017-11-16 04:02:19,495 [salt.loaded.int.module.cmdmod][INFO    ][31428] Executing command 'gluster volume info 'keystone-credential-keys' | grep 'nfs.disable: True'' in directory '/root'
2017-11-16 04:02:19,544 [salt.state       ][INFO    ][31428] unless execution succeeded
2017-11-16 04:02:19,545 [salt.state       ][INFO    ][31428] Completed state [gluster volume set 'keystone-credential-keys' 'nfs.disable' 'True'] at time 04:02:19.544660 duration_in_ms=51.432
2017-11-16 04:02:19,545 [salt.state       ][INFO    ][31428] Running state [gluster volume set 'keystone-credential-keys' 'diagnostics.client-log-level' 'WARNING'] at time 04:02:19.545185
2017-11-16 04:02:19,545 [salt.state       ][INFO    ][31428] Executing state cmd.run for gluster volume set 'keystone-credential-keys' 'diagnostics.client-log-level' 'WARNING'
2017-11-16 04:02:19,546 [salt.loaded.int.module.cmdmod][INFO    ][31428] Executing command 'gluster volume info 'keystone-credential-keys' | grep 'diagnostics.client-log-level: WARNING'' in directory '/root'
2017-11-16 04:02:19,595 [salt.state       ][INFO    ][31428] unless execution succeeded
2017-11-16 04:02:19,596 [salt.state       ][INFO    ][31428] Completed state [gluster volume set 'keystone-credential-keys' 'diagnostics.client-log-level' 'WARNING'] at time 04:02:19.595587 duration_in_ms=50.401
2017-11-16 04:02:19,596 [salt.state       ][INFO    ][31428] Running state [gluster volume set 'keystone-credential-keys' 'network.remote-dio' 'True'] at time 04:02:19.596049
2017-11-16 04:02:19,596 [salt.state       ][INFO    ][31428] Executing state cmd.run for gluster volume set 'keystone-credential-keys' 'network.remote-dio' 'True'
2017-11-16 04:02:19,597 [salt.loaded.int.module.cmdmod][INFO    ][31428] Executing command 'gluster volume info 'keystone-credential-keys' | grep 'network.remote-dio: True'' in directory '/root'
2017-11-16 04:02:19,644 [salt.state       ][INFO    ][31428] unless execution succeeded
2017-11-16 04:02:19,644 [salt.state       ][INFO    ][31428] Completed state [gluster volume set 'keystone-credential-keys' 'network.remote-dio' 'True'] at time 04:02:19.644387 duration_in_ms=48.336
2017-11-16 04:02:19,645 [salt.state       ][INFO    ][31428] Running state [keystone-credential-keys] at time 04:02:19.645330
2017-11-16 04:02:19,646 [salt.state       ][INFO    ][31428] Executing state glusterfs.started for keystone-credential-keys
2017-11-16 04:02:19,646 [salt.loaded.int.module.cmdmod][INFO    ][31428] Executing command 'gluster --version' in directory '/root'
2017-11-16 04:02:19,655 [salt.loaded.int.module.cmdmod][INFO    ][31428] Executing command 'gluster --xml --mode=script' in directory '/root'
2017-11-16 04:02:19,704 [salt.loaded.int.module.cmdmod][INFO    ][31428] Executing command 'gluster --version' in directory '/root'
2017-11-16 04:02:19,713 [salt.loaded.int.module.cmdmod][INFO    ][31428] Executing command 'gluster --xml --mode=script' in directory '/root'
2017-11-16 04:02:19,767 [salt.state       ][INFO    ][31428] Volume keystone-credential-keys is already started
2017-11-16 04:02:19,767 [salt.state       ][INFO    ][31428] Completed state [keystone-credential-keys] at time 04:02:19.766881 duration_in_ms=121.551
2017-11-16 04:02:19,770 [salt.minion      ][INFO    ][31428] Returning information for job: 20171116040215000801
2017-11-16 04:02:28,461 [salt.minion      ][INFO    ][22407] User sudo_ubuntu Executing command test.ping with jid 20171116040228450969
2017-11-16 04:02:28,478 [salt.minion      ][INFO    ][31810] Starting a new job with PID 31810
2017-11-16 04:02:28,503 [salt.minion      ][INFO    ][31810] Returning information for job: 20171116040228450969
2017-11-16 04:02:28,635 [salt.minion      ][INFO    ][22407] User sudo_ubuntu Executing command cmd.run with jid 20171116040228624198
2017-11-16 04:02:28,650 [salt.minion      ][INFO    ][31815] Starting a new job with PID 31815
2017-11-16 04:02:28,654 [salt.loaded.int.module.cmdmod][INFO    ][31815] Executing command 'gluster peer status; gluster volume status' in directory '/root'
2017-11-16 04:02:28,761 [salt.minion      ][INFO    ][31815] Returning information for job: 20171116040228624198
2017-11-16 04:32:22,351 [salt.utils.schedule][INFO    ][22407] Running scheduled job: __mine_interval
2017-11-16 04:32:44,696 [salt.minion      ][INFO    ][22407] User sudo_ubuntu Executing command cp.push_dir with jid 20171116043244685170
2017-11-16 04:32:44,721 [salt.minion      ][INFO    ][32044] Starting a new job with PID 32044
