2017-10-29 08:28:34,536 [salt.cli.daemons ][WARNING ][2503] IMPORTANT: Do not use md5 hashing algorithm! Please set "hash_type" to sha256 in Salt Minion config!
2017-10-29 08:29:24,760 [salt.state       ][ERROR   ][3750] No contents found in top file
2017-10-29 08:31:09,040 [salt.utils.parsers][WARNING ][2503] Minion received a SIGTERM. Exiting.
2017-10-29 08:33:24,205 [salt.cli.daemons ][WARNING ][3277] IMPORTANT: Do not use md5 hashing algorithm! Please set "hash_type" to sha256 in Salt Minion config!
2017-10-29 08:36:25,436 [salt.loaded.int.module.cmdmod][ERROR   ][11100] Command 'virsh net-destroy default 2>&1 1>/dev/null; virsh net-undefine default' failed with return code: 1
2017-10-29 08:36:25,437 [salt.loaded.int.module.cmdmod][ERROR   ][11100] stderr: error: failed to get network 'default'
error: Network not found: no network with matching name 'default'
2017-10-29 08:36:25,437 [salt.loaded.int.module.cmdmod][ERROR   ][11100] retcode: 1
2017-10-29 08:36:25,437 [salt.state       ][ERROR   ][11100] {'pid': 15965, 'retcode': 1, 'stderr': "error: failed to get network 'default'\nerror: Network not found: no network with matching name 'default'", 'stdout': ''}
2017-10-29 08:36:42,437 [py.warnings      ][WARNING ][16047] /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-10-29 08:47:07,075 [salt.loaded.int.module.cmdmod][ERROR   ][16047] Command 'sfdisk -d /dev/nbd9' failed with return code: 1
2017-10-29 08:47:07,076 [salt.loaded.int.module.cmdmod][ERROR   ][16047] output: sfdisk: cannot open /dev/nbd9: Inappropriate ioctl for device
2017-10-29 08:47:13,365 [salt.loaded.int.module.cmdmod][ERROR   ][16047] Command 'sfdisk -d /dev/nbd9' failed with return code: 1
2017-10-29 08:47:13,365 [salt.loaded.int.module.cmdmod][ERROR   ][16047] output: sfdisk: cannot open /dev/nbd9: Inappropriate ioctl for device
2017-10-29 08:47:22,086 [salt.loaded.int.module.cmdmod][ERROR   ][16047] Command 'sfdisk -d /dev/nbd9' failed with return code: 1
2017-10-29 08:47:22,086 [salt.loaded.int.module.cmdmod][ERROR   ][16047] output: sfdisk: cannot open /dev/nbd9: Inappropriate ioctl for device
2017-10-29 08:47:30,355 [salt.loaded.int.module.cmdmod][ERROR   ][16047] Command 'sfdisk -d /dev/nbd9' failed with return code: 1
2017-10-29 08:47:30,356 [salt.loaded.int.module.cmdmod][ERROR   ][16047] output: sfdisk: cannot open /dev/nbd9: Inappropriate ioctl for device
2017-10-29 08:47:38,615 [salt.loaded.int.module.cmdmod][ERROR   ][16047] Command 'sfdisk -d /dev/nbd9' failed with return code: 1
2017-10-29 08:47:38,615 [salt.loaded.int.module.cmdmod][ERROR   ][16047] output: sfdisk: cannot open /dev/nbd9: Inappropriate ioctl for device
2017-10-29 08:47:44,801 [salt.loaded.int.module.cmdmod][ERROR   ][16047] 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-10-29 08:47:47,053 [salt.loaded.int.module.cmdmod][INFO    ][23929] Executing command ['systemctl', 'status', 'salt-minion.service', '-n', '0'] in directory '/root'
2017-10-29 08:47:47,060 [salt.loaded.int.module.cmdmod][INFO    ][23929] Executing command ['systemctl', 'is-enabled', 'salt-minion.service'] in directory '/root'
2017-10-29 08:47:47,070 [salt.loaded.int.module.cmdmod][INFO    ][23929] Executing command ['systemd-run', '--scope', 'systemctl', 'restart', 'salt-minion.service'] in directory '/root'
2017-10-29 08:47:47,077 [salt.utils.parsers][WARNING ][3277] Minion received a SIGTERM. Exiting.
2017-10-29 08:47:47,341 [salt.cli.daemons ][INFO    ][24018] Setting up the Salt Minion "kvm01.baremetal-mcp-ocata-odl-ha.local"
2017-10-29 08:47:47,871 [salt.minion      ][INFO    ][24018] Creating minion process manager
2017-10-29 08:47:47,872 [salt.cli.daemons ][WARNING ][24018] IMPORTANT: Do not use md5 hashing algorithm! Please set "hash_type" to sha256 in Salt Minion config!
2017-10-29 08:47:47,872 [salt.cli.daemons ][INFO    ][24018] The Salt Minion is starting up
2017-10-29 08:47:47,872 [salt.minion      ][INFO    ][24018] Minion is starting as user 'root'
2017-10-29 08:47:47,872 [salt.utils.event ][INFO    ][24018] Starting pull socket on /var/run/salt/minion/minion_event_127643860a_pull.ipc
2017-10-29 08:47:48,774 [salt.loaded.int.module.cmdmod][INFO    ][24018] Executing command ['date', '+%z'] in directory '/root'
2017-10-29 08:47:48,782 [salt.utils.schedule][INFO    ][24018] Updating job settings for scheduled job: __mine_interval
2017-10-29 08:47:48,784 [salt.minion      ][INFO    ][24018] Added mine.update to scheduler
2017-10-29 08:47:48,914 [salt.minion      ][INFO    ][24018] Minion is ready to receive requests!
2017-10-29 08:47:49,915 [salt.utils.schedule][INFO    ][24018] Running scheduled job: __mine_interval
2017-10-29 08:47:55,501 [salt.minion      ][INFO    ][24018] User sudo_ubuntu Executing command saltutil.sync_all with jid 20171029084755489283
2017-10-29 08:47:55,514 [salt.minion      ][INFO    ][24146] Starting a new job with PID 24146
2017-10-29 08:47:57,112 [salt.state       ][INFO    ][24146] Loading fresh modules for state activity
2017-10-29 08:47:57,134 [salt.state       ][ERROR   ][24146] No contents found in top file
2017-10-29 08:47:57,135 [salt.utils.extmods][INFO    ][24146] Creating module dir '/var/cache/salt/minion/extmods/beacons'
2017-10-29 08:47:57,137 [salt.utils.extmods][INFO    ][24146] Syncing beacons for environment 'base'
2017-10-29 08:47:57,137 [salt.utils.extmods][INFO    ][24146] Loading cache from salt://_beacons, for base)
2017-10-29 08:47:57,138 [salt.fileclient  ][INFO    ][24146] Caching directory '_beacons/' for environment 'base'
2017-10-29 08:47:57,170 [salt.utils.extmods][INFO    ][24146] Syncing modules for environment 'base'
2017-10-29 08:47:57,170 [salt.utils.extmods][INFO    ][24146] Loading cache from salt://_modules, for base)
2017-10-29 08:47:57,170 [salt.fileclient  ][INFO    ][24146] Caching directory '_modules/' for environment 'base'
2017-10-29 08:47:57,289 [salt.fileclient  ][INFO    ][24146] Fetching file from saltenv 'base', ** done ** '_modules/ceph_ng.py'
2017-10-29 08:47:57,315 [salt.fileclient  ][INFO    ][24146] Fetching file from saltenv 'base', ** done ** '_modules/cinderng.py'
2017-10-29 08:47:57,338 [salt.fileclient  ][INFO    ][24146] Fetching file from saltenv 'base', ** done ** '_modules/contrail.py'
2017-10-29 08:47:57,466 [salt.fileclient  ][INFO    ][24146] Fetching file from saltenv 'base', ** done ** '_modules/creds.py'
2017-10-29 08:47:57,593 [salt.fileclient  ][INFO    ][24146] Fetching file from saltenv 'base', ** done ** '_modules/devops_utils.py'
2017-10-29 08:47:57,699 [salt.fileclient  ][INFO    ][24146] Fetching file from saltenv 'base', ** done ** '_modules/encode_json.py'
2017-10-29 08:47:57,773 [salt.fileclient  ][INFO    ][24146] Fetching file from saltenv 'base', ** done ** '_modules/gerrit.py'
2017-10-29 08:47:57,958 [salt.fileclient  ][INFO    ][24146] Fetching file from saltenv 'base', ** done ** '_modules/glanceng.py'
2017-10-29 08:47:58,070 [salt.fileclient  ][INFO    ][24146] Fetching file from saltenv 'base', ** done ** '_modules/heat.py'
2017-10-29 08:47:58,083 [salt.fileclient  ][INFO    ][24146] Fetching file from saltenv 'base', ** done ** '_modules/heka_alarming.py'
2017-10-29 08:47:58,229 [salt.fileclient  ][INFO    ][24146] Fetching file from saltenv 'base', ** done ** '_modules/helm.py'
2017-10-29 08:47:58,376 [salt.fileclient  ][INFO    ][24146] Fetching file from saltenv 'base', ** done ** '_modules/jenkins_common.py'
2017-10-29 08:47:58,634 [salt.fileclient  ][INFO    ][24146] Fetching file from saltenv 'base', ** done ** '_modules/keystone_policy.py'
2017-10-29 08:47:58,651 [salt.fileclient  ][INFO    ][24146] Fetching file from saltenv 'base', ** done ** '_modules/linux_hosts.py'
2017-10-29 08:47:58,802 [salt.fileclient  ][INFO    ][24146] Fetching file from saltenv 'base', ** done ** '_modules/linux_netlink.py'
2017-10-29 08:47:59,027 [salt.fileclient  ][INFO    ][24146] Fetching file from saltenv 'base', ** done ** '_modules/maas.py'
2017-10-29 08:47:59,113 [salt.fileclient  ][INFO    ][24146] Fetching file from saltenv 'base', ** done ** '_modules/maas_client.py'
2017-10-29 08:47:59,180 [salt.fileclient  ][INFO    ][24146] Fetching file from saltenv 'base', ** done ** '_modules/multipart.py'
2017-10-29 08:47:59,395 [salt.fileclient  ][INFO    ][24146] Fetching file from saltenv 'base', ** done ** '_modules/nagios_alarming.py'
2017-10-29 08:47:59,603 [salt.fileclient  ][INFO    ][24146] Fetching file from saltenv 'base', ** done ** '_modules/neutronng.py'
2017-10-29 08:47:59,771 [salt.fileclient  ][INFO    ][24146] Fetching file from saltenv 'base', ** done ** '_modules/novang.py'
2017-10-29 08:47:59,812 [salt.fileclient  ][INFO    ][24146] Fetching file from saltenv 'base', ** done ** '_modules/reclass.py'
2017-10-29 08:47:59,876 [salt.fileclient  ][INFO    ][24146] Fetching file from saltenv 'base', ** done ** '_modules/rsyslog_util.py'
2017-10-29 08:47:59,999 [salt.fileclient  ][INFO    ][24146] Fetching file from saltenv 'base', ** done ** '_modules/rundeck.py'
2017-10-29 08:48:00,109 [salt.fileclient  ][INFO    ][24146] Fetching file from saltenv 'base', ** done ** '_modules/saltkey.py'
2017-10-29 08:48:00,222 [salt.fileclient  ][INFO    ][24146] Fetching file from saltenv 'base', ** done ** '_modules/saltresource.py'
2017-10-29 08:48:00,374 [salt.fileclient  ][INFO    ][24146] Fetching file from saltenv 'base', ** done ** '_modules/seedng.py'
2017-10-29 08:48:00,492 [salt.fileclient  ][INFO    ][24146] Fetching file from saltenv 'base', ** done ** '_modules/testing/credentials.py'
2017-10-29 08:48:00,684 [salt.fileclient  ][INFO    ][24146] Fetching file from saltenv 'base', ** done ** '_modules/testing/django.py'
2017-10-29 08:48:00,876 [salt.fileclient  ][INFO    ][24146] Fetching file from saltenv 'base', ** done ** '_modules/testing/django_client_proxy.py'
2017-10-29 08:48:01,104 [salt.fileclient  ][INFO    ][24146] Fetching file from saltenv 'base', ** done ** '_modules/utils.py'
2017-10-29 08:48:01,230 [salt.fileclient  ][INFO    ][24146] Fetching file from saltenv 'base', ** done ** '_modules/virtng.py'
2017-10-29 08:48:01,234 [salt.utils.extmods][INFO    ][24146] Copying '/var/cache/salt/minion/files/base/_modules/__init__.py' to '/var/cache/salt/minion/extmods/modules/__init__.py'
2017-10-29 08:48:01,234 [salt.utils.extmods][INFO    ][24146] Copying '/var/cache/salt/minion/files/base/_modules/ceph_ng.py' to '/var/cache/salt/minion/extmods/modules/ceph_ng.py'
2017-10-29 08:48:01,316 [salt.utils.extmods][INFO    ][24146] Copying '/var/cache/salt/minion/files/base/_modules/cinderng.py' to '/var/cache/salt/minion/extmods/modules/cinderng.py'
2017-10-29 08:48:01,468 [salt.utils.extmods][INFO    ][24146] Copying '/var/cache/salt/minion/files/base/_modules/contrail.py' to '/var/cache/salt/minion/extmods/modules/contrail.py'
2017-10-29 08:48:01,519 [salt.utils.extmods][INFO    ][24146] Copying '/var/cache/salt/minion/files/base/_modules/creds.py' to '/var/cache/salt/minion/extmods/modules/creds.py'
2017-10-29 08:48:01,591 [salt.utils.extmods][INFO    ][24146] Copying '/var/cache/salt/minion/files/base/_modules/devops_utils.py' to '/var/cache/salt/minion/extmods/modules/devops_utils.py'
2017-10-29 08:48:01,750 [salt.utils.extmods][INFO    ][24146] Copying '/var/cache/salt/minion/files/base/_modules/encode_json.py' to '/var/cache/salt/minion/extmods/modules/encode_json.py'
2017-10-29 08:48:01,795 [salt.utils.extmods][INFO    ][24146] Copying '/var/cache/salt/minion/files/base/_modules/gerrit.py' to '/var/cache/salt/minion/extmods/modules/gerrit.py'
2017-10-29 08:48:01,918 [salt.utils.extmods][INFO    ][24146] Copying '/var/cache/salt/minion/files/base/_modules/glanceng.py' to '/var/cache/salt/minion/extmods/modules/glanceng.py'
2017-10-29 08:48:02,037 [salt.utils.extmods][INFO    ][24146] Copying '/var/cache/salt/minion/files/base/_modules/heat.py' to '/var/cache/salt/minion/extmods/modules/heat.py'
2017-10-29 08:48:02,136 [salt.utils.extmods][INFO    ][24146] Copying '/var/cache/salt/minion/files/base/_modules/heka_alarming.py' to '/var/cache/salt/minion/extmods/modules/heka_alarming.py'
2017-10-29 08:48:02,178 [salt.utils.extmods][INFO    ][24146] Copying '/var/cache/salt/minion/files/base/_modules/helm.py' to '/var/cache/salt/minion/extmods/modules/helm.py'
2017-10-29 08:48:02,199 [salt.utils.extmods][INFO    ][24146] Copying '/var/cache/salt/minion/files/base/_modules/jenkins_common.py' to '/var/cache/salt/minion/extmods/modules/jenkins_common.py'
2017-10-29 08:48:02,223 [salt.utils.extmods][INFO    ][24146] Copying '/var/cache/salt/minion/files/base/_modules/keystone_policy.py' to '/var/cache/salt/minion/extmods/modules/keystone_policy.py'
2017-10-29 08:48:02,270 [salt.utils.extmods][INFO    ][24146] Copying '/var/cache/salt/minion/files/base/_modules/linux_hosts.py' to '/var/cache/salt/minion/extmods/modules/linux_hosts.py'
2017-10-29 08:48:02,329 [salt.utils.extmods][INFO    ][24146] Copying '/var/cache/salt/minion/files/base/_modules/linux_netlink.py' to '/var/cache/salt/minion/extmods/modules/linux_netlink.py'
2017-10-29 08:48:02,330 [salt.utils.extmods][INFO    ][24146] Copying '/var/cache/salt/minion/files/base/_modules/maas.py' to '/var/cache/salt/minion/extmods/modules/maas.py'
2017-10-29 08:48:02,331 [salt.utils.extmods][INFO    ][24146] Copying '/var/cache/salt/minion/files/base/_modules/maas_client.py' to '/var/cache/salt/minion/extmods/modules/maas_client.py'
2017-10-29 08:48:02,331 [salt.utils.extmods][INFO    ][24146] Copying '/var/cache/salt/minion/files/base/_modules/multipart.py' to '/var/cache/salt/minion/extmods/modules/multipart.py'
2017-10-29 08:48:02,332 [salt.utils.extmods][INFO    ][24146] Copying '/var/cache/salt/minion/files/base/_modules/nagios_alarming.py' to '/var/cache/salt/minion/extmods/modules/nagios_alarming.py'
2017-10-29 08:48:02,332 [salt.utils.extmods][INFO    ][24146] Copying '/var/cache/salt/minion/files/base/_modules/neutronng.py' to '/var/cache/salt/minion/extmods/modules/neutronng.py'
2017-10-29 08:48:02,332 [salt.utils.extmods][INFO    ][24146] Copying '/var/cache/salt/minion/files/base/_modules/novang.py' to '/var/cache/salt/minion/extmods/modules/novang.py'
2017-10-29 08:48:02,520 [salt.utils.extmods][INFO    ][24146] Copying '/var/cache/salt/minion/files/base/_modules/reclass.py' to '/var/cache/salt/minion/extmods/modules/reclass.py'
2017-10-29 08:48:02,520 [salt.utils.extmods][INFO    ][24146] Copying '/var/cache/salt/minion/files/base/_modules/rsyslog_util.py' to '/var/cache/salt/minion/extmods/modules/rsyslog_util.py'
2017-10-29 08:48:02,521 [salt.utils.extmods][INFO    ][24146] Copying '/var/cache/salt/minion/files/base/_modules/rundeck.py' to '/var/cache/salt/minion/extmods/modules/rundeck.py'
2017-10-29 08:48:02,521 [salt.utils.extmods][INFO    ][24146] Copying '/var/cache/salt/minion/files/base/_modules/saltkey.py' to '/var/cache/salt/minion/extmods/modules/saltkey.py'
2017-10-29 08:48:02,522 [salt.utils.extmods][INFO    ][24146] Copying '/var/cache/salt/minion/files/base/_modules/saltresource.py' to '/var/cache/salt/minion/extmods/modules/saltresource.py'
2017-10-29 08:48:02,527 [salt.utils.extmods][INFO    ][24146] Copying '/var/cache/salt/minion/files/base/_modules/seedng.py' to '/var/cache/salt/minion/extmods/modules/seedng.py'
2017-10-29 08:48:02,533 [salt.utils.extmods][INFO    ][24146] Copying '/var/cache/salt/minion/files/base/_modules/testing/__init__.py' to '/var/cache/salt/minion/extmods/modules/testing/__init__.py'
2017-10-29 08:48:02,533 [salt.utils.extmods][INFO    ][24146] Copying '/var/cache/salt/minion/files/base/_modules/testing/credentials.py' to '/var/cache/salt/minion/extmods/modules/testing/credentials.py'
2017-10-29 08:48:02,533 [salt.utils.extmods][INFO    ][24146] Copying '/var/cache/salt/minion/files/base/_modules/testing/django.py' to '/var/cache/salt/minion/extmods/modules/testing/django.py'
2017-10-29 08:48:02,533 [salt.utils.extmods][INFO    ][24146] 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-10-29 08:48:02,534 [salt.utils.extmods][INFO    ][24146] Copying '/var/cache/salt/minion/files/base/_modules/utils.py' to '/var/cache/salt/minion/extmods/modules/utils.py'
2017-10-29 08:48:02,534 [salt.utils.extmods][INFO    ][24146] Copying '/var/cache/salt/minion/files/base/_modules/virtng.py' to '/var/cache/salt/minion/extmods/modules/virtng.py'
2017-10-29 08:48:02,540 [salt.utils.extmods][INFO    ][24146] Syncing states for environment 'base'
2017-10-29 08:48:02,540 [salt.utils.extmods][INFO    ][24146] Loading cache from salt://_states, for base)
2017-10-29 08:48:02,540 [salt.fileclient  ][INFO    ][24146] Caching directory '_states/' for environment 'base'
2017-10-29 08:48:02,676 [salt.fileclient  ][INFO    ][24146] Fetching file from saltenv 'base', ** done ** '_states/cinderng.py'
2017-10-29 08:48:02,762 [salt.fileclient  ][INFO    ][24146] Fetching file from saltenv 'base', ** done ** '_states/contrail.py'
2017-10-29 08:48:02,838 [salt.fileclient  ][INFO    ][24146] Fetching file from saltenv 'base', ** done ** '_states/gerrit.py'
2017-10-29 08:48:02,906 [salt.fileclient  ][INFO    ][24146] Fetching file from saltenv 'base', ** done ** '_states/glanceng.py'
2017-10-29 08:48:02,916 [salt.fileclient  ][INFO    ][24146] Fetching file from saltenv 'base', ** done ** '_states/grafana3_dashboard.py'
2017-10-29 08:48:02,925 [salt.fileclient  ][INFO    ][24146] Fetching file from saltenv 'base', ** done ** '_states/grafana3_datasource.py'
2017-10-29 08:48:02,949 [salt.fileclient  ][INFO    ][24146] Fetching file from saltenv 'base', ** done ** '_states/heat.py'
2017-10-29 08:48:02,978 [salt.fileclient  ][INFO    ][24146] Fetching file from saltenv 'base', ** done ** '_states/helm_release.py'
2017-10-29 08:48:02,999 [salt.fileclient  ][INFO    ][24146] Fetching file from saltenv 'base', ** done ** '_states/jenkins_approval.py'
2017-10-29 08:48:03,078 [salt.fileclient  ][INFO    ][24146] Fetching file from saltenv 'base', ** done ** '_states/jenkins_artifactory.py'
2017-10-29 08:48:03,108 [salt.fileclient  ][INFO    ][24146] Fetching file from saltenv 'base', ** done ** '_states/jenkins_credential.py'
2017-10-29 08:48:03,142 [salt.fileclient  ][INFO    ][24146] Fetching file from saltenv 'base', ** done ** '_states/jenkins_job.py'
2017-10-29 08:48:03,199 [salt.fileclient  ][INFO    ][24146] Fetching file from saltenv 'base', ** done ** '_states/jenkins_lib.py'
2017-10-29 08:48:03,227 [salt.fileclient  ][INFO    ][24146] Fetching file from saltenv 'base', ** done ** '_states/jenkins_node.py'
2017-10-29 08:48:03,318 [salt.fileclient  ][INFO    ][24146] Fetching file from saltenv 'base', ** done ** '_states/jenkins_plugin.py'
2017-10-29 08:48:03,349 [salt.fileclient  ][INFO    ][24146] Fetching file from saltenv 'base', ** done ** '_states/jenkins_security.py'
2017-10-29 08:48:03,368 [salt.fileclient  ][INFO    ][24146] Fetching file from saltenv 'base', ** done ** '_states/jenkins_slack.py'
2017-10-29 08:48:03,390 [salt.fileclient  ][INFO    ][24146] Fetching file from saltenv 'base', ** done ** '_states/jenkins_smtp.py'
2017-10-29 08:48:03,408 [salt.fileclient  ][INFO    ][24146] Fetching file from saltenv 'base', ** done ** '_states/jenkins_theme.py'
2017-10-29 08:48:03,431 [salt.fileclient  ][INFO    ][24146] Fetching file from saltenv 'base', ** done ** '_states/jenkins_user.py'
2017-10-29 08:48:03,459 [salt.fileclient  ][INFO    ][24146] Fetching file from saltenv 'base', ** done ** '_states/jenkins_view.py'
2017-10-29 08:48:03,486 [salt.fileclient  ][INFO    ][24146] Fetching file from saltenv 'base', ** done ** '_states/keystone_policy.py'
2017-10-29 08:48:03,543 [salt.fileclient  ][INFO    ][24146] Fetching file from saltenv 'base', ** done ** '_states/kibana_object.py'
2017-10-29 08:48:03,648 [salt.fileclient  ][INFO    ][24146] Fetching file from saltenv 'base', ** done ** '_states/neutronng.py'
2017-10-29 08:48:03,807 [salt.fileclient  ][INFO    ][24146] Fetching file from saltenv 'base', ** done ** '_states/novang.py'
2017-10-29 08:48:03,976 [salt.fileclient  ][INFO    ][24146] Fetching file from saltenv 'base', ** done ** '_states/reclass.py'
2017-10-29 08:48:04,053 [salt.fileclient  ][INFO    ][24146] Fetching file from saltenv 'base', ** done ** '_states/rundeck_project.py'
2017-10-29 08:48:04,174 [salt.fileclient  ][INFO    ][24146] Fetching file from saltenv 'base', ** done ** '_states/rundeck_scm.py'
2017-10-29 08:48:04,271 [salt.fileclient  ][INFO    ][24146] Fetching file from saltenv 'base', ** done ** '_states/rundeck_secret.py'
2017-10-29 08:48:04,274 [salt.utils.extmods][INFO    ][24146] Copying '/var/cache/salt/minion/files/base/_states/cinderng.py' to '/var/cache/salt/minion/extmods/states/cinderng.py'
2017-10-29 08:48:04,274 [salt.utils.extmods][INFO    ][24146] Copying '/var/cache/salt/minion/files/base/_states/contrail.py' to '/var/cache/salt/minion/extmods/states/contrail.py'
2017-10-29 08:48:04,274 [salt.utils.extmods][INFO    ][24146] Copying '/var/cache/salt/minion/files/base/_states/gerrit.py' to '/var/cache/salt/minion/extmods/states/gerrit.py'
2017-10-29 08:48:04,274 [salt.utils.extmods][INFO    ][24146] Copying '/var/cache/salt/minion/files/base/_states/glanceng.py' to '/var/cache/salt/minion/extmods/states/glanceng.py'
2017-10-29 08:48:04,275 [salt.utils.extmods][INFO    ][24146] Copying '/var/cache/salt/minion/files/base/_states/grafana3_dashboard.py' to '/var/cache/salt/minion/extmods/states/grafana3_dashboard.py'
2017-10-29 08:48:04,275 [salt.utils.extmods][INFO    ][24146] Copying '/var/cache/salt/minion/files/base/_states/grafana3_datasource.py' to '/var/cache/salt/minion/extmods/states/grafana3_datasource.py'
2017-10-29 08:48:04,275 [salt.utils.extmods][INFO    ][24146] Copying '/var/cache/salt/minion/files/base/_states/heat.py' to '/var/cache/salt/minion/extmods/states/heat.py'
2017-10-29 08:48:04,275 [salt.utils.extmods][INFO    ][24146] Copying '/var/cache/salt/minion/files/base/_states/helm_release.py' to '/var/cache/salt/minion/extmods/states/helm_release.py'
2017-10-29 08:48:04,276 [salt.utils.extmods][INFO    ][24146] Copying '/var/cache/salt/minion/files/base/_states/jenkins_approval.py' to '/var/cache/salt/minion/extmods/states/jenkins_approval.py'
2017-10-29 08:48:04,276 [salt.utils.extmods][INFO    ][24146] Copying '/var/cache/salt/minion/files/base/_states/jenkins_artifactory.py' to '/var/cache/salt/minion/extmods/states/jenkins_artifactory.py'
2017-10-29 08:48:04,276 [salt.utils.extmods][INFO    ][24146] Copying '/var/cache/salt/minion/files/base/_states/jenkins_credential.py' to '/var/cache/salt/minion/extmods/states/jenkins_credential.py'
2017-10-29 08:48:04,276 [salt.utils.extmods][INFO    ][24146] Copying '/var/cache/salt/minion/files/base/_states/jenkins_job.py' to '/var/cache/salt/minion/extmods/states/jenkins_job.py'
2017-10-29 08:48:04,277 [salt.utils.extmods][INFO    ][24146] Copying '/var/cache/salt/minion/files/base/_states/jenkins_lib.py' to '/var/cache/salt/minion/extmods/states/jenkins_lib.py'
2017-10-29 08:48:04,277 [salt.utils.extmods][INFO    ][24146] Copying '/var/cache/salt/minion/files/base/_states/jenkins_node.py' to '/var/cache/salt/minion/extmods/states/jenkins_node.py'
2017-10-29 08:48:04,277 [salt.utils.extmods][INFO    ][24146] Copying '/var/cache/salt/minion/files/base/_states/jenkins_plugin.py' to '/var/cache/salt/minion/extmods/states/jenkins_plugin.py'
2017-10-29 08:48:04,277 [salt.utils.extmods][INFO    ][24146] Copying '/var/cache/salt/minion/files/base/_states/jenkins_security.py' to '/var/cache/salt/minion/extmods/states/jenkins_security.py'
2017-10-29 08:48:04,278 [salt.utils.extmods][INFO    ][24146] Copying '/var/cache/salt/minion/files/base/_states/jenkins_slack.py' to '/var/cache/salt/minion/extmods/states/jenkins_slack.py'
2017-10-29 08:48:04,278 [salt.utils.extmods][INFO    ][24146] Copying '/var/cache/salt/minion/files/base/_states/jenkins_smtp.py' to '/var/cache/salt/minion/extmods/states/jenkins_smtp.py'
2017-10-29 08:48:04,278 [salt.utils.extmods][INFO    ][24146] Copying '/var/cache/salt/minion/files/base/_states/jenkins_theme.py' to '/var/cache/salt/minion/extmods/states/jenkins_theme.py'
2017-10-29 08:48:04,278 [salt.utils.extmods][INFO    ][24146] Copying '/var/cache/salt/minion/files/base/_states/jenkins_user.py' to '/var/cache/salt/minion/extmods/states/jenkins_user.py'
2017-10-29 08:48:04,279 [salt.utils.extmods][INFO    ][24146] Copying '/var/cache/salt/minion/files/base/_states/jenkins_view.py' to '/var/cache/salt/minion/extmods/states/jenkins_view.py'
2017-10-29 08:48:04,279 [salt.utils.extmods][INFO    ][24146] Copying '/var/cache/salt/minion/files/base/_states/keystone_policy.py' to '/var/cache/salt/minion/extmods/states/keystone_policy.py'
2017-10-29 08:48:04,279 [salt.utils.extmods][INFO    ][24146] Copying '/var/cache/salt/minion/files/base/_states/kibana_object.py' to '/var/cache/salt/minion/extmods/states/kibana_object.py'
2017-10-29 08:48:04,279 [salt.utils.extmods][INFO    ][24146] Copying '/var/cache/salt/minion/files/base/_states/maas_cluster.py' to '/var/cache/salt/minion/extmods/states/maas_cluster.py'
2017-10-29 08:48:04,280 [salt.utils.extmods][INFO    ][24146] Copying '/var/cache/salt/minion/files/base/_states/neutronng.py' to '/var/cache/salt/minion/extmods/states/neutronng.py'
2017-10-29 08:48:04,280 [salt.utils.extmods][INFO    ][24146] Copying '/var/cache/salt/minion/files/base/_states/novang.py' to '/var/cache/salt/minion/extmods/states/novang.py'
2017-10-29 08:48:04,280 [salt.utils.extmods][INFO    ][24146] Copying '/var/cache/salt/minion/files/base/_states/reclass.py' to '/var/cache/salt/minion/extmods/states/reclass.py'
2017-10-29 08:48:04,280 [salt.utils.extmods][INFO    ][24146] Copying '/var/cache/salt/minion/files/base/_states/rundeck_project.py' to '/var/cache/salt/minion/extmods/states/rundeck_project.py'
2017-10-29 08:48:04,281 [salt.utils.extmods][INFO    ][24146] Copying '/var/cache/salt/minion/files/base/_states/rundeck_scm.py' to '/var/cache/salt/minion/extmods/states/rundeck_scm.py'
2017-10-29 08:48:04,281 [salt.utils.extmods][INFO    ][24146] Copying '/var/cache/salt/minion/files/base/_states/rundeck_secret.py' to '/var/cache/salt/minion/extmods/states/rundeck_secret.py'
2017-10-29 08:48:04,283 [salt.utils.extmods][INFO    ][24146] Creating module dir '/var/cache/salt/minion/extmods/sdb'
2017-10-29 08:48:04,286 [salt.utils.extmods][INFO    ][24146] Syncing sdb for environment 'base'
2017-10-29 08:48:04,286 [salt.utils.extmods][INFO    ][24146] Loading cache from salt://_sdb, for base)
2017-10-29 08:48:04,286 [salt.fileclient  ][INFO    ][24146] Caching directory '_sdb/' for environment 'base'
2017-10-29 08:48:04,315 [salt.utils.extmods][INFO    ][24146] Syncing grains for environment 'base'
2017-10-29 08:48:04,316 [salt.utils.extmods][INFO    ][24146] Loading cache from salt://_grains, for base)
2017-10-29 08:48:04,316 [salt.fileclient  ][INFO    ][24146] Caching directory '_grains/' for environment 'base'
2017-10-29 08:48:04,353 [salt.fileclient  ][INFO    ][24146] Fetching file from saltenv 'base', ** done ** '_grains/ceilometer_policy.py'
2017-10-29 08:48:04,376 [salt.fileclient  ][INFO    ][24146] Fetching file from saltenv 'base', ** done ** '_grains/ceph.py'
2017-10-29 08:48:04,457 [salt.fileclient  ][INFO    ][24146] Fetching file from saltenv 'base', ** done ** '_grains/cinder_policy.py'
2017-10-29 08:48:04,499 [salt.fileclient  ][INFO    ][24146] Fetching file from saltenv 'base', ** done ** '_grains/docker_swarm.py'
2017-10-29 08:48:04,548 [salt.fileclient  ][INFO    ][24146] Fetching file from saltenv 'base', ** done ** '_grains/glance_policy.py'
2017-10-29 08:48:04,590 [salt.fileclient  ][INFO    ][24146] Fetching file from saltenv 'base', ** done ** '_grains/heat_policy.py'
2017-10-29 08:48:04,634 [salt.fileclient  ][INFO    ][24146] Fetching file from saltenv 'base', ** done ** '_grains/jenkins_plugins.py'
2017-10-29 08:48:04,675 [salt.fileclient  ][INFO    ][24146] Fetching file from saltenv 'base', ** done ** '_grains/keystone_policy.py'
2017-10-29 08:48:04,735 [salt.fileclient  ][INFO    ][24146] Fetching file from saltenv 'base', ** done ** '_grains/kubernetes.py'
2017-10-29 08:48:04,776 [salt.fileclient  ][INFO    ][24146] Fetching file from saltenv 'base', ** done ** '_grains/neutron_policy.py'
2017-10-29 08:48:04,795 [salt.fileclient  ][INFO    ][24146] Fetching file from saltenv 'base', ** done ** '_grains/nova_policy.py'
2017-10-29 08:48:04,836 [salt.fileclient  ][INFO    ][24146] Fetching file from saltenv 'base', ** done ** '_grains/ssh_fingerprints.py'
2017-10-29 08:48:04,839 [salt.utils.extmods][INFO    ][24146] Copying '/var/cache/salt/minion/files/base/_grains/ceilometer_policy.py' to '/var/cache/salt/minion/extmods/grains/ceilometer_policy.py'
2017-10-29 08:48:04,870 [salt.utils.extmods][INFO    ][24146] Copying '/var/cache/salt/minion/files/base/_grains/ceph.py' to '/var/cache/salt/minion/extmods/grains/ceph.py'
2017-10-29 08:48:04,886 [salt.utils.extmods][INFO    ][24146] Copying '/var/cache/salt/minion/files/base/_grains/cinder_policy.py' to '/var/cache/salt/minion/extmods/grains/cinder_policy.py'
2017-10-29 08:48:04,892 [salt.utils.extmods][INFO    ][24146] Copying '/var/cache/salt/minion/files/base/_grains/docker_swarm.py' to '/var/cache/salt/minion/extmods/grains/docker_swarm.py'
2017-10-29 08:48:04,909 [salt.utils.extmods][INFO    ][24146] Copying '/var/cache/salt/minion/files/base/_grains/glance_policy.py' to '/var/cache/salt/minion/extmods/grains/glance_policy.py'
2017-10-29 08:48:04,931 [salt.utils.extmods][INFO    ][24146] Copying '/var/cache/salt/minion/files/base/_grains/heat_policy.py' to '/var/cache/salt/minion/extmods/grains/heat_policy.py'
2017-10-29 08:48:04,942 [salt.utils.extmods][INFO    ][24146] Copying '/var/cache/salt/minion/files/base/_grains/jenkins_plugins.py' to '/var/cache/salt/minion/extmods/grains/jenkins_plugins.py'
2017-10-29 08:48:04,964 [salt.utils.extmods][INFO    ][24146] Copying '/var/cache/salt/minion/files/base/_grains/keystone_policy.py' to '/var/cache/salt/minion/extmods/grains/keystone_policy.py'
2017-10-29 08:48:04,970 [salt.utils.extmods][INFO    ][24146] Copying '/var/cache/salt/minion/files/base/_grains/kubernetes.py' to '/var/cache/salt/minion/extmods/grains/kubernetes.py'
2017-10-29 08:48:04,987 [salt.utils.extmods][INFO    ][24146] Copying '/var/cache/salt/minion/files/base/_grains/neutron_policy.py' to '/var/cache/salt/minion/extmods/grains/neutron_policy.py'
2017-10-29 08:48:05,018 [salt.utils.extmods][INFO    ][24146] Copying '/var/cache/salt/minion/files/base/_grains/nova_policy.py' to '/var/cache/salt/minion/extmods/grains/nova_policy.py'
2017-10-29 08:48:05,020 [salt.utils.extmods][INFO    ][24146] Copying '/var/cache/salt/minion/files/base/_grains/ssh_fingerprints.py' to '/var/cache/salt/minion/extmods/grains/ssh_fingerprints.py'
2017-10-29 08:48:05,053 [salt.utils.extmods][INFO    ][24146] Creating module dir '/var/cache/salt/minion/extmods/renderers'
2017-10-29 08:48:05,055 [salt.utils.extmods][INFO    ][24146] Syncing renderers for environment 'base'
2017-10-29 08:48:05,056 [salt.utils.extmods][INFO    ][24146] Loading cache from salt://_renderers, for base)
2017-10-29 08:48:05,056 [salt.fileclient  ][INFO    ][24146] Caching directory '_renderers/' for environment 'base'
2017-10-29 08:48:05,088 [salt.utils.extmods][INFO    ][24146] Creating module dir '/var/cache/salt/minion/extmods/returners'
2017-10-29 08:48:05,091 [salt.utils.extmods][INFO    ][24146] Syncing returners for environment 'base'
2017-10-29 08:48:05,091 [salt.utils.extmods][INFO    ][24146] Loading cache from salt://_returners, for base)
2017-10-29 08:48:05,091 [salt.fileclient  ][INFO    ][24146] Caching directory '_returners/' for environment 'base'
2017-10-29 08:48:05,126 [salt.utils.extmods][INFO    ][24146] Creating module dir '/var/cache/salt/minion/extmods/output'
2017-10-29 08:48:05,129 [salt.utils.extmods][INFO    ][24146] Syncing output for environment 'base'
2017-10-29 08:48:05,129 [salt.utils.extmods][INFO    ][24146] Loading cache from salt://_output, for base)
2017-10-29 08:48:05,129 [salt.fileclient  ][INFO    ][24146] Caching directory '_output/' for environment 'base'
2017-10-29 08:48:05,159 [salt.utils.extmods][INFO    ][24146] Creating module dir '/var/cache/salt/minion/extmods/utils'
2017-10-29 08:48:05,173 [salt.utils.extmods][INFO    ][24146] Syncing utils for environment 'base'
2017-10-29 08:48:05,174 [salt.utils.extmods][INFO    ][24146] Loading cache from salt://_utils, for base)
2017-10-29 08:48:05,174 [salt.fileclient  ][INFO    ][24146] Caching directory '_utils/' for environment 'base'
2017-10-29 08:48:05,206 [salt.utils.extmods][INFO    ][24146] Creating module dir '/var/cache/salt/minion/extmods/log_handlers'
2017-10-29 08:48:05,208 [salt.utils.extmods][INFO    ][24146] Syncing log_handlers for environment 'base'
2017-10-29 08:48:05,209 [salt.utils.extmods][INFO    ][24146] Loading cache from salt://_log_handlers, for base)
2017-10-29 08:48:05,209 [salt.fileclient  ][INFO    ][24146] Caching directory '_log_handlers/' for environment 'base'
2017-10-29 08:48:05,241 [salt.utils.extmods][INFO    ][24146] Creating module dir '/var/cache/salt/minion/extmods/proxy'
2017-10-29 08:48:05,243 [salt.utils.extmods][INFO    ][24146] Syncing proxy for environment 'base'
2017-10-29 08:48:05,243 [salt.utils.extmods][INFO    ][24146] Loading cache from salt://_proxy, for base)
2017-10-29 08:48:05,244 [salt.fileclient  ][INFO    ][24146] Caching directory '_proxy/' for environment 'base'
2017-10-29 08:48:05,273 [salt.utils.extmods][INFO    ][24146] Creating module dir '/var/cache/salt/minion/extmods/engines'
2017-10-29 08:48:05,276 [salt.utils.extmods][INFO    ][24146] Syncing engines for environment 'base'
2017-10-29 08:48:05,276 [salt.utils.extmods][INFO    ][24146] Loading cache from salt://_engines, for base)
2017-10-29 08:48:05,276 [salt.fileclient  ][INFO    ][24146] Caching directory '_engines/' for environment 'base'
2017-10-29 08:48:05,310 [salt.minion      ][INFO    ][24146] Returning information for job: 20171029084755489283
2017-10-29 08:48:06,029 [salt.minion      ][INFO    ][24018] User sudo_ubuntu Executing command state.sls with jid 20171029084806020216
2017-10-29 08:48:06,044 [salt.minion      ][INFO    ][24224] Starting a new job with PID 24224
2017-10-29 08:48:06,388 [salt.state       ][INFO    ][24224] Loading fresh modules for state activity
2017-10-29 08:48:06,410 [salt.fileclient  ][INFO    ][24224] Fetching file from saltenv 'base', ** done ** 'salt/control/init.sls'
2017-10-29 08:48:06,440 [salt.fileclient  ][INFO    ][24224] Fetching file from saltenv 'base', ** done ** 'salt/control/virt.sls'
2017-10-29 08:48:06,481 [salt.fileclient  ][INFO    ][24224] Fetching file from saltenv 'base', ** done ** 'salt/map.jinja'
2017-10-29 08:48:06,592 [salt.fileclient  ][INFO    ][24224] Fetching file from saltenv 'base', ** done ** 'salt/minion/init.sls'
2017-10-29 08:48:06,606 [salt.fileclient  ][INFO    ][24224] Fetching file from saltenv 'base', ** done ** 'salt/minion/service.sls'
2017-10-29 08:48:06,631 [salt.fileclient  ][INFO    ][24224] Fetching file from saltenv 'base', ** done ** 'salt/map.jinja'
2017-10-29 08:48:06,688 [salt.fileclient  ][INFO    ][24224] Fetching file from saltenv 'base', ** done ** 'linux/meta/salt.yml'
2017-10-29 08:48:06,855 [salt.fileclient  ][INFO    ][24224] Fetching file from saltenv 'base', ** done ** 'linux/map.jinja'
2017-10-29 08:48:06,900 [salt.fileclient  ][INFO    ][24224] Fetching file from saltenv 'base', ** done ** 'linux/meta/sphinx.yml'
2017-10-29 08:48:06,919 [salt.fileclient  ][INFO    ][24224] Fetching file from saltenv 'base', ** done ** 'keepalived/meta/sphinx.yml'
2017-10-29 08:48:06,932 [salt.fileclient  ][INFO    ][24224] Fetching file from saltenv 'base', ** done ** 'keepalived/map.jinja'
2017-10-29 08:48:06,946 [salt.fileclient  ][INFO    ][24224] Fetching file from saltenv 'base', ** done ** 'glusterfs/meta/sphinx.yml'
2017-10-29 08:48:06,953 [salt.loaded.int.module.cmdmod][INFO    ][24224] Executing command 'gluster --version 2>/dev/null || echo "unknown" |head -1' in directory '/root'
2017-10-29 08:48:06,973 [salt.fileclient  ][INFO    ][24224] Fetching file from saltenv 'base', ** done ** 'salt/meta/sphinx.yml'
2017-10-29 08:48:06,987 [py.warnings      ][WARNING ][24224] /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-10-29 08:48:06,987 [salt.loaded.int.module.cmdmod][INFO    ][24224] Executing command 'salt-minion --version' in directory '/root'
2017-10-29 08:48:07,269 [salt.fileclient  ][INFO    ][24224] Fetching file from saltenv 'base', ** done ** 'keepalived/meta/salt.yml'
2017-10-29 08:48:07,291 [salt.fileclient  ][INFO    ][24224] Fetching file from saltenv 'base', ** done ** 'glusterfs/meta/salt.yml'
2017-10-29 08:48:07,304 [salt.fileclient  ][INFO    ][24224] Fetching file from saltenv 'base', ** done ** 'openssh/meta/salt.yml'
2017-10-29 08:48:07,318 [salt.fileclient  ][INFO    ][24224] Fetching file from saltenv 'base', ** done ** 'salt/meta/salt.yml'
2017-10-29 08:48:07,366 [salt.fileclient  ][INFO    ][24224] Fetching file from saltenv 'base', ** done ** 'linux/meta/meta.yml'
2017-10-29 08:48:07,403 [salt.fileclient  ][INFO    ][24224] Fetching file from saltenv 'base', ** done ** 'salt/meta/meta.yml'
2017-10-29 08:48:07,460 [salt.fileclient  ][INFO    ][24224] Fetching file from saltenv 'base', ** done ** 'salt/minion/grains.sls'
2017-10-29 08:48:07,482 [salt.fileclient  ][INFO    ][24224] Fetching file from saltenv 'base', ** done ** 'salt/map.jinja'
2017-10-29 08:48:07,534 [salt.fileclient  ][INFO    ][24224] Fetching file from saltenv 'base', ** done ** 'linux/meta/salt.yml'
2017-10-29 08:48:07,553 [salt.fileclient  ][INFO    ][24224] Fetching file from saltenv 'base', ** done ** 'linux/map.jinja'
2017-10-29 08:48:07,617 [salt.fileclient  ][INFO    ][24224] Fetching file from saltenv 'base', ** done ** 'linux/meta/sphinx.yml'
2017-10-29 08:48:07,636 [salt.fileclient  ][INFO    ][24224] Fetching file from saltenv 'base', ** done ** 'keepalived/meta/sphinx.yml'
2017-10-29 08:48:07,649 [salt.fileclient  ][INFO    ][24224] Fetching file from saltenv 'base', ** done ** 'keepalived/map.jinja'
2017-10-29 08:48:07,665 [salt.fileclient  ][INFO    ][24224] Fetching file from saltenv 'base', ** done ** 'glusterfs/meta/sphinx.yml'
2017-10-29 08:48:07,672 [salt.loaded.int.module.cmdmod][INFO    ][24224] Executing command 'gluster --version 2>/dev/null || echo "unknown" |head -1' in directory '/root'
2017-10-29 08:48:07,710 [salt.fileclient  ][INFO    ][24224] Fetching file from saltenv 'base', ** done ** 'salt/meta/sphinx.yml'
2017-10-29 08:48:07,725 [salt.loaded.int.module.cmdmod][INFO    ][24224] Executing command 'salt-minion --version' in directory '/root'
2017-10-29 08:48:07,970 [salt.fileclient  ][INFO    ][24224] Fetching file from saltenv 'base', ** done ** 'keepalived/meta/salt.yml'
2017-10-29 08:48:07,986 [salt.fileclient  ][INFO    ][24224] Fetching file from saltenv 'base', ** done ** 'glusterfs/meta/salt.yml'
2017-10-29 08:48:07,995 [salt.fileclient  ][INFO    ][24224] Fetching file from saltenv 'base', ** done ** 'openssh/meta/salt.yml'
2017-10-29 08:48:08,005 [salt.fileclient  ][INFO    ][24224] Fetching file from saltenv 'base', ** done ** 'salt/meta/salt.yml'
2017-10-29 08:48:08,056 [salt.fileclient  ][INFO    ][24224] Fetching file from saltenv 'base', ** done ** 'linux/meta/meta.yml'
2017-10-29 08:48:08,088 [salt.fileclient  ][INFO    ][24224] Fetching file from saltenv 'base', ** done ** 'salt/meta/meta.yml'
2017-10-29 08:48:08,150 [salt.fileclient  ][INFO    ][24224] Fetching file from saltenv 'base', ** done ** 'salt/minion/cert.sls'
2017-10-29 08:48:08,203 [salt.fileclient  ][INFO    ][24224] Fetching file from saltenv 'base', ** done ** 'salt/map.jinja'
2017-10-29 08:48:08,567 [salt.state       ][INFO    ][24224] Running state [salt-minion] at time 08:48:08.566637
2017-10-29 08:48:08,567 [salt.state       ][INFO    ][24224] Executing state pkg.installed for salt-minion
2017-10-29 08:48:08,567 [salt.loaded.int.module.cmdmod][INFO    ][24224] Executing command ['dpkg-query', '--showformat', '${Status} ${Package} ${Version} ${Architecture}\n', '-W'] in directory '/root'
2017-10-29 08:48:08,870 [salt.state       ][INFO    ][24224] Package salt-minion is already installed
2017-10-29 08:48:08,870 [salt.state       ][INFO    ][24224] Completed state [salt-minion] at time 08:48:08.869841 duration_in_ms=303.203
2017-10-29 08:48:08,870 [salt.state       ][INFO    ][24224] Running state [salt_minion_dependency_packages] at time 08:48:08.870082
2017-10-29 08:48:08,870 [salt.state       ][INFO    ][24224] Executing state pkg.installed for salt_minion_dependency_packages
2017-10-29 08:48:08,873 [salt.state       ][INFO    ][24224] All specified packages are already installed
2017-10-29 08:48:08,874 [salt.state       ][INFO    ][24224] Completed state [salt_minion_dependency_packages] at time 08:48:08.873547 duration_in_ms=3.465
2017-10-29 08:48:08,876 [salt.state       ][INFO    ][24224] Running state [/etc/salt/minion.d/minion.conf] at time 08:48:08.875798
2017-10-29 08:48:08,876 [salt.state       ][INFO    ][24224] Executing state file.managed for /etc/salt/minion.d/minion.conf
2017-10-29 08:48:08,960 [salt.fileclient  ][INFO    ][24224] Fetching file from saltenv 'base', ** done ** 'salt/files/minion.conf'
2017-10-29 08:48:09,006 [salt.fileclient  ][INFO    ][24224] Fetching file from saltenv 'base', ** done ** 'salt/map.jinja'
2017-10-29 08:48:09,052 [salt.fileclient  ][INFO    ][24224] Fetching file from saltenv 'base', ** done ** 'linux/map.jinja'
2017-10-29 08:48:09,088 [salt.state       ][INFO    ][24224] File /etc/salt/minion.d/minion.conf is in the correct state
2017-10-29 08:48:09,088 [salt.state       ][INFO    ][24224] Completed state [/etc/salt/minion.d/minion.conf] at time 08:48:09.087842 duration_in_ms=212.044
2017-10-29 08:48:09,088 [salt.state       ][INFO    ][24224] Running state [/etc/salt/minion.d/_virt.conf] at time 08:48:09.088150
2017-10-29 08:48:09,088 [salt.state       ][INFO    ][24224] Executing state file.managed for /etc/salt/minion.d/_virt.conf
2017-10-29 08:48:09,117 [salt.state       ][INFO    ][24224] File /etc/salt/minion.d/_virt.conf is in the correct state
2017-10-29 08:48:09,117 [salt.state       ][INFO    ][24224] Completed state [/etc/salt/minion.d/_virt.conf] at time 08:48:09.117318 duration_in_ms=29.168
2017-10-29 08:48:09,119 [salt.state       ][INFO    ][24224] Running state [salt-minion] at time 08:48:09.118769
2017-10-29 08:48:09,119 [salt.state       ][INFO    ][24224] Executing state service.running for salt-minion
2017-10-29 08:48:09,119 [salt.loaded.int.module.cmdmod][INFO    ][24224] Executing command ['systemctl', 'status', 'salt-minion.service', '-n', '0'] in directory '/root'
2017-10-29 08:48:09,139 [salt.loaded.int.module.cmdmod][INFO    ][24224] Executing command ['systemctl', 'is-active', 'salt-minion.service'] in directory '/root'
2017-10-29 08:48:09,148 [salt.loaded.int.module.cmdmod][INFO    ][24224] Executing command ['systemctl', 'is-enabled', 'salt-minion.service'] in directory '/root'
2017-10-29 08:48:09,156 [salt.state       ][INFO    ][24224] The service salt-minion is already running
2017-10-29 08:48:09,157 [salt.state       ][INFO    ][24224] Completed state [salt-minion] at time 08:48:09.156453 duration_in_ms=37.683
2017-10-29 08:48:09,158 [salt.state       ][INFO    ][24224] Running state [/etc/salt/grains.d] at time 08:48:09.157850
2017-10-29 08:48:09,158 [salt.state       ][INFO    ][24224] Executing state file.directory for /etc/salt/grains.d
2017-10-29 08:48:09,159 [salt.state       ][INFO    ][24224] Directory /etc/salt/grains.d is in the correct state
2017-10-29 08:48:09,159 [salt.state       ][INFO    ][24224] Completed state [/etc/salt/grains.d] at time 08:48:09.158843 duration_in_ms=0.993
2017-10-29 08:48:09,159 [salt.state       ][INFO    ][24224] Running state [/etc/salt/grains] at time 08:48:09.159293
2017-10-29 08:48:09,160 [salt.state       ][INFO    ][24224] Executing state file.managed for /etc/salt/grains
2017-10-29 08:48:09,160 [salt.state       ][INFO    ][24224] File /etc/salt/grains exists with proper permissions. No changes made.
2017-10-29 08:48:09,160 [salt.state       ][INFO    ][24224] Completed state [/etc/salt/grains] at time 08:48:09.160066 duration_in_ms=0.772
2017-10-29 08:48:09,160 [salt.state       ][INFO    ][24224] Running state [/etc/salt/grains.d/placeholder] at time 08:48:09.160364
2017-10-29 08:48:09,161 [salt.state       ][INFO    ][24224] Executing state file.managed for /etc/salt/grains.d/placeholder
2017-10-29 08:48:09,161 [salt.state       ][INFO    ][24224] File /etc/salt/grains.d/placeholder exists with proper permissions. No changes made.
2017-10-29 08:48:09,161 [salt.state       ][INFO    ][24224] Completed state [/etc/salt/grains.d/placeholder] at time 08:48:09.161088 duration_in_ms=0.723
2017-10-29 08:48:09,161 [salt.state       ][INFO    ][24224] Running state [/etc/salt/grains.d/sphinx] at time 08:48:09.161382
2017-10-29 08:48:09,162 [salt.state       ][INFO    ][24224] Executing state file.managed for /etc/salt/grains.d/sphinx
2017-10-29 08:48:09,227 [salt.state       ][INFO    ][24224] File changed:
--- 
+++ 
@@ -49,7 +49,6 @@
               - 10.167.4.141
               - 127.0.0.1
               - 192.168.11.251
-              - 192.168.122.1
         system:
           name: System
           param:

2017-10-29 08:48:09,228 [salt.state       ][INFO    ][24224] Completed state [/etc/salt/grains.d/sphinx] at time 08:48:09.227613 duration_in_ms=66.232
2017-10-29 08:48:09,229 [salt.state       ][INFO    ][24224] Running state [python -c "import yaml; stream = file('/etc/salt/grains.d/sphinx', 'r'); yaml.load(stream); stream.close()"] at time 08:48:09.228444
2017-10-29 08:48:09,229 [salt.state       ][INFO    ][24224] Executing state cmd.wait for python -c "import yaml; stream = file('/etc/salt/grains.d/sphinx', 'r'); yaml.load(stream); stream.close()"
2017-10-29 08:48:09,229 [salt.state       ][INFO    ][24224] No changes made for python -c "import yaml; stream = file('/etc/salt/grains.d/sphinx', 'r'); yaml.load(stream); stream.close()"
2017-10-29 08:48:09,229 [salt.state       ][INFO    ][24224] Completed state [python -c "import yaml; stream = file('/etc/salt/grains.d/sphinx', 'r'); yaml.load(stream); stream.close()"] at time 08:48:09.229188 duration_in_ms=0.744
2017-10-29 08:48:09,229 [salt.state       ][INFO    ][24224] Running state [python -c "import yaml; stream = file('/etc/salt/grains.d/sphinx', 'r'); yaml.load(stream); stream.close()"] at time 08:48:09.229349
2017-10-29 08:48:09,230 [salt.state       ][INFO    ][24224] Executing state cmd.mod_watch for python -c "import yaml; stream = file('/etc/salt/grains.d/sphinx', 'r'); yaml.load(stream); stream.close()"
2017-10-29 08:48:09,230 [salt.loaded.int.module.cmdmod][INFO    ][24224] Executing command 'python -c "import yaml; stream = file('/etc/salt/grains.d/sphinx', 'r'); yaml.load(stream); stream.close()"' in directory '/root'
2017-10-29 08:48:09,312 [salt.state       ][INFO    ][24224] {'pid': 24326, 'retcode': 0, 'stderr': '', 'stdout': ''}
2017-10-29 08:48:09,312 [salt.state       ][INFO    ][24224] Completed state [python -c "import yaml; stream = file('/etc/salt/grains.d/sphinx', 'r'); yaml.load(stream); stream.close()"] at time 08:48:09.311906 duration_in_ms=82.557
2017-10-29 08:48:09,312 [salt.state       ][INFO    ][24224] Running state [/etc/salt/grains.d/dns_records] at time 08:48:09.312374
2017-10-29 08:48:09,313 [salt.state       ][INFO    ][24224] Executing state file.managed for /etc/salt/grains.d/dns_records
2017-10-29 08:48:09,533 [salt.state       ][INFO    ][24224] File /etc/salt/grains.d/dns_records is in the correct state
2017-10-29 08:48:09,533 [salt.state       ][INFO    ][24224] Completed state [/etc/salt/grains.d/dns_records] at time 08:48:09.532824 duration_in_ms=220.449
2017-10-29 08:48:09,534 [salt.state       ][INFO    ][24224] Running state [python -c "import yaml; stream = file('/etc/salt/grains.d/dns_records', 'r'); yaml.load(stream); stream.close()"] at time 08:48:09.533572
2017-10-29 08:48:09,534 [salt.state       ][INFO    ][24224] Executing state cmd.wait for python -c "import yaml; stream = file('/etc/salt/grains.d/dns_records', 'r'); yaml.load(stream); stream.close()"
2017-10-29 08:48:09,534 [salt.state       ][INFO    ][24224] No changes made for python -c "import yaml; stream = file('/etc/salt/grains.d/dns_records', 'r'); yaml.load(stream); stream.close()"
2017-10-29 08:48:09,534 [salt.state       ][INFO    ][24224] Completed state [python -c "import yaml; stream = file('/etc/salt/grains.d/dns_records', 'r'); yaml.load(stream); stream.close()"] at time 08:48:09.534247 duration_in_ms=0.676
2017-10-29 08:48:09,535 [salt.state       ][INFO    ][24224] Running state [/etc/salt/grains.d/salt] at time 08:48:09.534577
2017-10-29 08:48:09,535 [salt.state       ][INFO    ][24224] Executing state file.managed for /etc/salt/grains.d/salt
2017-10-29 08:48:09,622 [salt.state       ][INFO    ][24224] File /etc/salt/grains.d/salt is in the correct state
2017-10-29 08:48:09,622 [salt.state       ][INFO    ][24224] Completed state [/etc/salt/grains.d/salt] at time 08:48:09.622065 duration_in_ms=87.488
2017-10-29 08:48:09,623 [salt.state       ][INFO    ][24224] Running state [python -c "import yaml; stream = file('/etc/salt/grains.d/salt', 'r'); yaml.load(stream); stream.close()"] at time 08:48:09.622771
2017-10-29 08:48:09,623 [salt.state       ][INFO    ][24224] Executing state cmd.wait for python -c "import yaml; stream = file('/etc/salt/grains.d/salt', 'r'); yaml.load(stream); stream.close()"
2017-10-29 08:48:09,623 [salt.state       ][INFO    ][24224] No changes made for python -c "import yaml; stream = file('/etc/salt/grains.d/salt', 'r'); yaml.load(stream); stream.close()"
2017-10-29 08:48:09,624 [salt.state       ][INFO    ][24224] Completed state [python -c "import yaml; stream = file('/etc/salt/grains.d/salt', 'r'); yaml.load(stream); stream.close()"] at time 08:48:09.623601 duration_in_ms=0.83
2017-10-29 08:48:09,625 [salt.state       ][INFO    ][24224] Running state [cat /etc/salt/grains.d/* > /etc/salt/grains] at time 08:48:09.624966
2017-10-29 08:48:09,625 [salt.state       ][INFO    ][24224] Executing state cmd.wait for cat /etc/salt/grains.d/* > /etc/salt/grains
2017-10-29 08:48:09,626 [salt.state       ][INFO    ][24224] No changes made for cat /etc/salt/grains.d/* > /etc/salt/grains
2017-10-29 08:48:09,626 [salt.state       ][INFO    ][24224] Completed state [cat /etc/salt/grains.d/* > /etc/salt/grains] at time 08:48:09.625794 duration_in_ms=0.828
2017-10-29 08:48:09,626 [salt.state       ][INFO    ][24224] Running state [cat /etc/salt/grains.d/* > /etc/salt/grains] at time 08:48:09.626026
2017-10-29 08:48:09,626 [salt.state       ][INFO    ][24224] Executing state cmd.mod_watch for cat /etc/salt/grains.d/* > /etc/salt/grains
2017-10-29 08:48:09,628 [salt.loaded.int.module.cmdmod][INFO    ][24224] Executing command 'cat /etc/salt/grains.d/* > /etc/salt/grains' in directory '/root'
2017-10-29 08:48:09,637 [salt.state       ][INFO    ][24224] {'pid': 24329, 'retcode': 0, 'stderr': '', 'stdout': ''}
2017-10-29 08:48:09,637 [salt.state       ][INFO    ][24224] Completed state [cat /etc/salt/grains.d/* > /etc/salt/grains] at time 08:48:09.637152 duration_in_ms=11.125
2017-10-29 08:48:09,638 [salt.state       ][INFO    ][24224] Running state [mine.update] at time 08:48:09.637796
2017-10-29 08:48:09,638 [salt.state       ][INFO    ][24224] Executing state module.wait for mine.update
2017-10-29 08:48:09,638 [salt.state       ][INFO    ][24224] No changes made for mine.update
2017-10-29 08:48:09,638 [salt.state       ][INFO    ][24224] Completed state [mine.update] at time 08:48:09.638338 duration_in_ms=0.542
2017-10-29 08:48:09,639 [salt.state       ][INFO    ][24224] Running state [mine.update] at time 08:48:09.638475
2017-10-29 08:48:09,639 [salt.state       ][INFO    ][24224] Executing state module.mod_watch for mine.update
2017-10-29 08:48:10,161 [salt.state       ][INFO    ][24224] {'ret': True}
2017-10-29 08:48:10,161 [salt.state       ][INFO    ][24224] Completed state [mine.update] at time 08:48:10.161429 duration_in_ms=522.952
2017-10-29 08:48:10,162 [salt.state       ][INFO    ][24224] Running state [ca-certificates] at time 08:48:10.161710
2017-10-29 08:48:10,162 [salt.state       ][INFO    ][24224] Executing state pkg.installed for ca-certificates
2017-10-29 08:48:10,165 [salt.state       ][INFO    ][24224] Package ca-certificates is already installed
2017-10-29 08:48:10,165 [salt.state       ][INFO    ][24224] Completed state [ca-certificates] at time 08:48:10.165458 duration_in_ms=3.748
2017-10-29 08:48:10,166 [salt.state       ][INFO    ][24224] Running state [update-ca-certificates] at time 08:48:10.166034
2017-10-29 08:48:10,166 [salt.state       ][INFO    ][24224] Executing state cmd.wait for update-ca-certificates
2017-10-29 08:48:10,167 [salt.state       ][INFO    ][24224] No changes made for update-ca-certificates
2017-10-29 08:48:10,167 [salt.state       ][INFO    ][24224] Completed state [update-ca-certificates] at time 08:48:10.166657 duration_in_ms=0.622
2017-10-29 08:48:10,167 [salt.state       ][INFO    ][24224] Running state [libvirt-dev] at time 08:48:10.166852
2017-10-29 08:48:10,167 [salt.state       ][INFO    ][24224] Executing state pkg.installed for libvirt-dev
2017-10-29 08:48:10,170 [salt.state       ][INFO    ][24224] Package libvirt-dev is already installed
2017-10-29 08:48:10,170 [salt.state       ][INFO    ][24224] Completed state [libvirt-dev] at time 08:48:10.169988 duration_in_ms=3.137
2017-10-29 08:48:10,170 [salt.state       ][INFO    ][24224] Running state [pkg-config] at time 08:48:10.170179
2017-10-29 08:48:10,170 [salt.state       ][INFO    ][24224] Executing state pkg.installed for pkg-config
2017-10-29 08:48:10,173 [salt.state       ][INFO    ][24224] Package pkg-config is already installed
2017-10-29 08:48:10,173 [salt.state       ][INFO    ][24224] Completed state [pkg-config] at time 08:48:10.173318 duration_in_ms=3.138
2017-10-29 08:48:10,174 [salt.state       ][INFO    ][24224] Running state [virtng.init] at time 08:48:10.173511
2017-10-29 08:48:10,174 [salt.state       ][INFO    ][24224] Executing state module.run for virtng.init
2017-10-29 08:48:10,231 [salt.loaded.int.module.cmdmod][INFO    ][24224] Executing command ['git', '--version'] in directory '/root'
2017-10-29 08:48:10,321 [salt.loaded.int.module.cmdmod][INFO    ][24224] Executing command 'virsh list --all --name| grep -E "^prx01.baremetal-mcp-ocata-odl-ha.local$"' in directory '/root'
2017-10-29 08:48:10,337 [salt.state       ][INFO    ][24224] unless execution succeeded
2017-10-29 08:48:10,337 [salt.state       ][INFO    ][24224] Completed state [virtng.init] at time 08:48:10.336767 duration_in_ms=163.254
2017-10-29 08:48:10,337 [salt.state       ][INFO    ][24224] Running state [virt.set_autostart] at time 08:48:10.336993
2017-10-29 08:48:10,337 [salt.state       ][INFO    ][24224] Executing state module.run for virt.set_autostart
2017-10-29 08:48:10,339 [salt.loaded.int.module.cmdmod][INFO    ][24224] Executing command 'virsh list --autostart --name| grep -E "^prx01.baremetal-mcp-ocata-odl-ha.local$"' in directory '/root'
2017-10-29 08:48:10,354 [salt.state       ][INFO    ][24224] unless execution succeeded
2017-10-29 08:48:10,354 [salt.state       ][INFO    ][24224] Completed state [virt.set_autostart] at time 08:48:10.354074 duration_in_ms=17.08
2017-10-29 08:48:10,354 [salt.state       ][INFO    ][24224] Running state [virtng.init] at time 08:48:10.354298
2017-10-29 08:48:10,354 [salt.state       ][INFO    ][24224] Executing state module.run for virtng.init
2017-10-29 08:48:10,356 [salt.loaded.int.module.cmdmod][INFO    ][24224] Executing command 'virsh list --all --name| grep -E "^ctl01.baremetal-mcp-ocata-odl-ha.local$"' in directory '/root'
2017-10-29 08:48:10,372 [salt.state       ][INFO    ][24224] unless execution succeeded
2017-10-29 08:48:10,372 [salt.state       ][INFO    ][24224] Completed state [virtng.init] at time 08:48:10.371839 duration_in_ms=17.54
2017-10-29 08:48:10,372 [salt.state       ][INFO    ][24224] Running state [virt.set_autostart] at time 08:48:10.372063
2017-10-29 08:48:10,372 [salt.state       ][INFO    ][24224] Executing state module.run for virt.set_autostart
2017-10-29 08:48:10,374 [salt.loaded.int.module.cmdmod][INFO    ][24224] Executing command 'virsh list --autostart --name| grep -E "^ctl01.baremetal-mcp-ocata-odl-ha.local$"' in directory '/root'
2017-10-29 08:48:10,388 [salt.state       ][INFO    ][24224] unless execution succeeded
2017-10-29 08:48:10,392 [salt.state       ][INFO    ][24224] Completed state [virt.set_autostart] at time 08:48:10.392009 duration_in_ms=19.944
2017-10-29 08:48:10,392 [salt.state       ][INFO    ][24224] Running state [virtng.init] at time 08:48:10.392237
2017-10-29 08:48:10,392 [salt.state       ][INFO    ][24224] Executing state module.run for virtng.init
2017-10-29 08:48:10,394 [salt.loaded.int.module.cmdmod][INFO    ][24224] Executing command 'virsh list --all --name| grep -E "^mdb01.baremetal-mcp-ocata-odl-ha.local$"' in directory '/root'
2017-10-29 08:48:10,408 [salt.state       ][INFO    ][24224] unless execution succeeded
2017-10-29 08:48:10,409 [salt.state       ][INFO    ][24224] Completed state [virtng.init] at time 08:48:10.408681 duration_in_ms=16.444
2017-10-29 08:48:10,409 [salt.state       ][INFO    ][24224] Running state [virt.set_autostart] at time 08:48:10.408897
2017-10-29 08:48:10,409 [salt.state       ][INFO    ][24224] Executing state module.run for virt.set_autostart
2017-10-29 08:48:10,411 [salt.loaded.int.module.cmdmod][INFO    ][24224] Executing command 'virsh list --autostart --name| grep -E "^mdb01.baremetal-mcp-ocata-odl-ha.local$"' in directory '/root'
2017-10-29 08:48:10,426 [salt.state       ][INFO    ][24224] unless execution succeeded
2017-10-29 08:48:10,426 [salt.state       ][INFO    ][24224] Completed state [virt.set_autostart] at time 08:48:10.425852 duration_in_ms=16.955
2017-10-29 08:48:10,426 [salt.state       ][INFO    ][24224] Running state [virtng.init] at time 08:48:10.426076
2017-10-29 08:48:10,426 [salt.state       ][INFO    ][24224] Executing state module.run for virtng.init
2017-10-29 08:48:10,428 [salt.loaded.int.module.cmdmod][INFO    ][24224] Executing command 'virsh list --all --name| grep -E "^msg01.baremetal-mcp-ocata-odl-ha.local$"' in directory '/root'
2017-10-29 08:48:10,443 [salt.state       ][INFO    ][24224] unless execution succeeded
2017-10-29 08:48:10,443 [salt.state       ][INFO    ][24224] Completed state [virtng.init] at time 08:48:10.442951 duration_in_ms=16.875
2017-10-29 08:48:10,443 [salt.state       ][INFO    ][24224] Running state [virt.set_autostart] at time 08:48:10.443170
2017-10-29 08:48:10,443 [salt.state       ][INFO    ][24224] Executing state module.run for virt.set_autostart
2017-10-29 08:48:10,445 [salt.loaded.int.module.cmdmod][INFO    ][24224] Executing command 'virsh list --autostart --name| grep -E "^msg01.baremetal-mcp-ocata-odl-ha.local$"' in directory '/root'
2017-10-29 08:48:10,460 [salt.state       ][INFO    ][24224] unless execution succeeded
2017-10-29 08:48:10,461 [salt.state       ][INFO    ][24224] Completed state [virt.set_autostart] at time 08:48:10.460643 duration_in_ms=17.473
2017-10-29 08:48:10,461 [salt.state       ][INFO    ][24224] Running state [virtng.init] at time 08:48:10.460853
2017-10-29 08:48:10,461 [salt.state       ][INFO    ][24224] Executing state module.run for virtng.init
2017-10-29 08:48:10,463 [salt.loaded.int.module.cmdmod][INFO    ][24224] Executing command 'virsh list --all --name| grep -E "^dbs01.baremetal-mcp-ocata-odl-ha.local$"' in directory '/root'
2017-10-29 08:48:10,477 [salt.state       ][INFO    ][24224] unless execution succeeded
2017-10-29 08:48:10,477 [salt.state       ][INFO    ][24224] Completed state [virtng.init] at time 08:48:10.477419 duration_in_ms=16.565
2017-10-29 08:48:10,478 [salt.state       ][INFO    ][24224] Running state [virt.set_autostart] at time 08:48:10.477632
2017-10-29 08:48:10,478 [salt.state       ][INFO    ][24224] Executing state module.run for virt.set_autostart
2017-10-29 08:48:10,480 [salt.loaded.int.module.cmdmod][INFO    ][24224] Executing command 'virsh list --autostart --name| grep -E "^dbs01.baremetal-mcp-ocata-odl-ha.local$"' in directory '/root'
2017-10-29 08:48:10,495 [salt.state       ][INFO    ][24224] unless execution succeeded
2017-10-29 08:48:10,495 [salt.state       ][INFO    ][24224] Completed state [virt.set_autostart] at time 08:48:10.494825 duration_in_ms=17.193
2017-10-29 08:48:10,497 [salt.minion      ][INFO    ][24224] Returning information for job: 20171029084806020216
2017-10-29 08:48:36,985 [salt.minion      ][INFO    ][24018] User sudo_ubuntu Executing command state.sls with jid 20171029084836969717
2017-10-29 08:48:36,999 [salt.minion      ][INFO    ][24384] Starting a new job with PID 24384
2017-10-29 08:48:38,405 [salt.state       ][INFO    ][24384] Loading fresh modules for state activity
2017-10-29 08:48:38,451 [salt.fileclient  ][INFO    ][24384] Fetching file from saltenv 'base', ** done ** 'salt/control/init.sls'
2017-10-29 08:48:38,469 [salt.fileclient  ][INFO    ][24384] Fetching file from saltenv 'base', ** done ** 'salt/control/virt.sls'
2017-10-29 08:48:38,547 [salt.fileclient  ][INFO    ][24384] Fetching file from saltenv 'base', ** done ** 'salt/map.jinja'
2017-10-29 08:48:38,617 [salt.fileclient  ][INFO    ][24384] Fetching file from saltenv 'base', ** done ** 'salt/minion/init.sls'
2017-10-29 08:48:38,633 [salt.fileclient  ][INFO    ][24384] Fetching file from saltenv 'base', ** done ** 'salt/minion/service.sls'
2017-10-29 08:48:38,673 [salt.fileclient  ][INFO    ][24384] Fetching file from saltenv 'base', ** done ** 'salt/map.jinja'
2017-10-29 08:48:38,739 [salt.fileclient  ][INFO    ][24384] Fetching file from saltenv 'base', ** done ** 'linux/meta/salt.yml'
2017-10-29 08:48:38,756 [salt.fileclient  ][INFO    ][24384] Fetching file from saltenv 'base', ** done ** 'linux/map.jinja'
2017-10-29 08:48:38,799 [salt.fileclient  ][INFO    ][24384] Fetching file from saltenv 'base', ** done ** 'linux/meta/sphinx.yml'
2017-10-29 08:48:38,816 [salt.fileclient  ][INFO    ][24384] Fetching file from saltenv 'base', ** done ** 'keepalived/meta/sphinx.yml'
2017-10-29 08:48:38,828 [salt.fileclient  ][INFO    ][24384] Fetching file from saltenv 'base', ** done ** 'keepalived/map.jinja'
2017-10-29 08:48:38,850 [salt.fileclient  ][INFO    ][24384] Fetching file from saltenv 'base', ** done ** 'glusterfs/meta/sphinx.yml'
2017-10-29 08:48:38,857 [salt.loaded.int.module.cmdmod][INFO    ][24384] Executing command 'gluster --version 2>/dev/null || echo "unknown" |head -1' in directory '/root'
2017-10-29 08:48:38,877 [salt.fileclient  ][INFO    ][24384] Fetching file from saltenv 'base', ** done ** 'salt/meta/sphinx.yml'
2017-10-29 08:48:38,891 [py.warnings      ][WARNING ][24384] /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-10-29 08:48:38,910 [salt.loaded.int.module.cmdmod][INFO    ][24384] Executing command 'salt-minion --version' in directory '/root'
2017-10-29 08:48:39,170 [salt.fileclient  ][INFO    ][24384] Fetching file from saltenv 'base', ** done ** 'keepalived/meta/salt.yml'
2017-10-29 08:48:39,189 [salt.fileclient  ][INFO    ][24384] Fetching file from saltenv 'base', ** done ** 'glusterfs/meta/salt.yml'
2017-10-29 08:48:39,201 [salt.fileclient  ][INFO    ][24384] Fetching file from saltenv 'base', ** done ** 'openssh/meta/salt.yml'
2017-10-29 08:48:39,213 [salt.fileclient  ][INFO    ][24384] Fetching file from saltenv 'base', ** done ** 'salt/meta/salt.yml'
2017-10-29 08:48:39,896 [salt.fileclient  ][INFO    ][24384] Fetching file from saltenv 'base', ** done ** 'linux/meta/meta.yml'
2017-10-29 08:48:39,931 [salt.fileclient  ][INFO    ][24384] Fetching file from saltenv 'base', ** done ** 'salt/meta/meta.yml'
2017-10-29 08:48:39,988 [salt.fileclient  ][INFO    ][24384] Fetching file from saltenv 'base', ** done ** 'salt/minion/grains.sls'
2017-10-29 08:48:40,008 [salt.fileclient  ][INFO    ][24384] Fetching file from saltenv 'base', ** done ** 'salt/map.jinja'
2017-10-29 08:48:40,059 [salt.fileclient  ][INFO    ][24384] Fetching file from saltenv 'base', ** done ** 'linux/meta/salt.yml'
2017-10-29 08:48:40,101 [salt.fileclient  ][INFO    ][24384] Fetching file from saltenv 'base', ** done ** 'linux/map.jinja'
2017-10-29 08:48:40,145 [salt.fileclient  ][INFO    ][24384] Fetching file from saltenv 'base', ** done ** 'linux/meta/sphinx.yml'
2017-10-29 08:48:40,161 [salt.fileclient  ][INFO    ][24384] Fetching file from saltenv 'base', ** done ** 'keepalived/meta/sphinx.yml'
2017-10-29 08:48:40,173 [salt.fileclient  ][INFO    ][24384] Fetching file from saltenv 'base', ** done ** 'keepalived/map.jinja'
2017-10-29 08:48:40,188 [salt.fileclient  ][INFO    ][24384] Fetching file from saltenv 'base', ** done ** 'glusterfs/meta/sphinx.yml'
2017-10-29 08:48:40,194 [salt.loaded.int.module.cmdmod][INFO    ][24384] Executing command 'gluster --version 2>/dev/null || echo "unknown" |head -1' in directory '/root'
2017-10-29 08:48:40,236 [salt.fileclient  ][INFO    ][24384] Fetching file from saltenv 'base', ** done ** 'salt/meta/sphinx.yml'
2017-10-29 08:48:40,251 [salt.loaded.int.module.cmdmod][INFO    ][24384] Executing command 'salt-minion --version' in directory '/root'
2017-10-29 08:48:40,507 [salt.fileclient  ][INFO    ][24384] Fetching file from saltenv 'base', ** done ** 'keepalived/meta/salt.yml'
2017-10-29 08:48:40,537 [salt.fileclient  ][INFO    ][24384] Fetching file from saltenv 'base', ** done ** 'glusterfs/meta/salt.yml'
2017-10-29 08:48:40,550 [salt.fileclient  ][INFO    ][24384] Fetching file from saltenv 'base', ** done ** 'openssh/meta/salt.yml'
2017-10-29 08:48:40,597 [salt.fileclient  ][INFO    ][24384] Fetching file from saltenv 'base', ** done ** 'salt/meta/salt.yml'
2017-10-29 08:48:40,647 [salt.fileclient  ][INFO    ][24384] Fetching file from saltenv 'base', ** done ** 'linux/meta/meta.yml'
2017-10-29 08:48:40,688 [salt.fileclient  ][INFO    ][24384] Fetching file from saltenv 'base', ** done ** 'salt/meta/meta.yml'
2017-10-29 08:48:40,752 [salt.fileclient  ][INFO    ][24384] Fetching file from saltenv 'base', ** done ** 'salt/minion/cert.sls'
2017-10-29 08:48:40,812 [salt.fileclient  ][INFO    ][24384] Fetching file from saltenv 'base', ** done ** 'salt/map.jinja'
2017-10-29 08:48:41,189 [salt.state       ][INFO    ][24384] Running state [salt-minion] at time 08:48:41.188525
2017-10-29 08:48:41,189 [salt.state       ][INFO    ][24384] Executing state pkg.installed for salt-minion
2017-10-29 08:48:41,189 [salt.loaded.int.module.cmdmod][INFO    ][24384] Executing command ['dpkg-query', '--showformat', '${Status} ${Package} ${Version} ${Architecture}\n', '-W'] in directory '/root'
2017-10-29 08:48:41,449 [salt.state       ][INFO    ][24384] Package salt-minion is already installed
2017-10-29 08:48:41,472 [salt.state       ][INFO    ][24384] Completed state [salt-minion] at time 08:48:41.472102 duration_in_ms=283.577
2017-10-29 08:48:41,472 [salt.state       ][INFO    ][24384] Running state [salt_minion_dependency_packages] at time 08:48:41.472371
2017-10-29 08:48:41,473 [salt.state       ][INFO    ][24384] Executing state pkg.installed for salt_minion_dependency_packages
2017-10-29 08:48:41,475 [salt.state       ][INFO    ][24384] All specified packages are already installed
2017-10-29 08:48:41,475 [salt.state       ][INFO    ][24384] Completed state [salt_minion_dependency_packages] at time 08:48:41.475373 duration_in_ms=3.002
2017-10-29 08:48:41,477 [salt.state       ][INFO    ][24384] Running state [/etc/salt/minion.d/minion.conf] at time 08:48:41.476944
2017-10-29 08:48:41,477 [salt.state       ][INFO    ][24384] Executing state file.managed for /etc/salt/minion.d/minion.conf
2017-10-29 08:48:41,500 [salt.fileclient  ][INFO    ][24384] Fetching file from saltenv 'base', ** done ** 'salt/files/minion.conf'
2017-10-29 08:48:41,551 [salt.fileclient  ][INFO    ][24384] Fetching file from saltenv 'base', ** done ** 'salt/map.jinja'
2017-10-29 08:48:41,594 [salt.fileclient  ][INFO    ][24384] Fetching file from saltenv 'base', ** done ** 'linux/map.jinja'
2017-10-29 08:48:41,626 [salt.state       ][INFO    ][24384] File /etc/salt/minion.d/minion.conf is in the correct state
2017-10-29 08:48:41,627 [salt.state       ][INFO    ][24384] Completed state [/etc/salt/minion.d/minion.conf] at time 08:48:41.626543 duration_in_ms=149.599
2017-10-29 08:48:41,627 [salt.state       ][INFO    ][24384] Running state [/etc/salt/minion.d/_virt.conf] at time 08:48:41.626848
2017-10-29 08:48:41,627 [salt.state       ][INFO    ][24384] Executing state file.managed for /etc/salt/minion.d/_virt.conf
2017-10-29 08:48:41,646 [salt.state       ][INFO    ][24384] File /etc/salt/minion.d/_virt.conf is in the correct state
2017-10-29 08:48:41,646 [salt.state       ][INFO    ][24384] Completed state [/etc/salt/minion.d/_virt.conf] at time 08:48:41.646100 duration_in_ms=19.251
2017-10-29 08:48:41,648 [salt.state       ][INFO    ][24384] Running state [salt-minion] at time 08:48:41.647534
2017-10-29 08:48:41,648 [salt.state       ][INFO    ][24384] Executing state service.running for salt-minion
2017-10-29 08:48:41,648 [salt.loaded.int.module.cmdmod][INFO    ][24384] Executing command ['systemctl', 'status', 'salt-minion.service', '-n', '0'] in directory '/root'
2017-10-29 08:48:41,667 [salt.loaded.int.module.cmdmod][INFO    ][24384] Executing command ['systemctl', 'is-active', 'salt-minion.service'] in directory '/root'
2017-10-29 08:48:41,675 [salt.loaded.int.module.cmdmod][INFO    ][24384] Executing command ['systemctl', 'is-enabled', 'salt-minion.service'] in directory '/root'
2017-10-29 08:48:41,684 [salt.state       ][INFO    ][24384] The service salt-minion is already running
2017-10-29 08:48:41,685 [salt.state       ][INFO    ][24384] Completed state [salt-minion] at time 08:48:41.684649 duration_in_ms=37.114
2017-10-29 08:48:41,686 [salt.state       ][INFO    ][24384] Running state [/etc/salt/grains.d] at time 08:48:41.686061
2017-10-29 08:48:41,686 [salt.state       ][INFO    ][24384] Executing state file.directory for /etc/salt/grains.d
2017-10-29 08:48:41,687 [salt.state       ][INFO    ][24384] Directory /etc/salt/grains.d is in the correct state
2017-10-29 08:48:41,687 [salt.state       ][INFO    ][24384] Completed state [/etc/salt/grains.d] at time 08:48:41.687034 duration_in_ms=0.973
2017-10-29 08:48:41,688 [salt.state       ][INFO    ][24384] Running state [/etc/salt/grains] at time 08:48:41.687468
2017-10-29 08:48:41,688 [salt.state       ][INFO    ][24384] Executing state file.managed for /etc/salt/grains
2017-10-29 08:48:41,688 [salt.state       ][INFO    ][24384] File /etc/salt/grains exists with proper permissions. No changes made.
2017-10-29 08:48:41,688 [salt.state       ][INFO    ][24384] Completed state [/etc/salt/grains] at time 08:48:41.688201 duration_in_ms=0.734
2017-10-29 08:48:41,689 [salt.state       ][INFO    ][24384] Running state [/etc/salt/grains.d/placeholder] at time 08:48:41.688492
2017-10-29 08:48:41,689 [salt.state       ][INFO    ][24384] Executing state file.managed for /etc/salt/grains.d/placeholder
2017-10-29 08:48:41,689 [salt.state       ][INFO    ][24384] File /etc/salt/grains.d/placeholder exists with proper permissions. No changes made.
2017-10-29 08:48:41,689 [salt.state       ][INFO    ][24384] Completed state [/etc/salt/grains.d/placeholder] at time 08:48:41.689148 duration_in_ms=0.657
2017-10-29 08:48:41,689 [salt.state       ][INFO    ][24384] Running state [/etc/salt/grains.d/sphinx] at time 08:48:41.689437
2017-10-29 08:48:41,690 [salt.state       ][INFO    ][24384] Executing state file.managed for /etc/salt/grains.d/sphinx
2017-10-29 08:48:41,776 [salt.state       ][INFO    ][24384] File /etc/salt/grains.d/sphinx is in the correct state
2017-10-29 08:48:41,777 [salt.state       ][INFO    ][24384] Completed state [/etc/salt/grains.d/sphinx] at time 08:48:41.776641 duration_in_ms=87.204
2017-10-29 08:48:41,777 [salt.state       ][INFO    ][24384] Running state [python -c "import yaml; stream = file('/etc/salt/grains.d/sphinx', 'r'); yaml.load(stream); stream.close()"] at time 08:48:41.777424
2017-10-29 08:48:41,778 [salt.state       ][INFO    ][24384] Executing state cmd.wait for python -c "import yaml; stream = file('/etc/salt/grains.d/sphinx', 'r'); yaml.load(stream); stream.close()"
2017-10-29 08:48:41,778 [salt.state       ][INFO    ][24384] No changes made for python -c "import yaml; stream = file('/etc/salt/grains.d/sphinx', 'r'); yaml.load(stream); stream.close()"
2017-10-29 08:48:41,778 [salt.state       ][INFO    ][24384] Completed state [python -c "import yaml; stream = file('/etc/salt/grains.d/sphinx', 'r'); yaml.load(stream); stream.close()"] at time 08:48:41.778089 duration_in_ms=0.666
2017-10-29 08:48:41,778 [salt.state       ][INFO    ][24384] Running state [/etc/salt/grains.d/dns_records] at time 08:48:41.778378
2017-10-29 08:48:41,779 [salt.state       ][INFO    ][24384] Executing state file.managed for /etc/salt/grains.d/dns_records
2017-10-29 08:48:41,842 [salt.state       ][INFO    ][24384] File /etc/salt/grains.d/dns_records is in the correct state
2017-10-29 08:48:41,843 [salt.state       ][INFO    ][24384] Completed state [/etc/salt/grains.d/dns_records] at time 08:48:41.842512 duration_in_ms=64.134
2017-10-29 08:48:41,843 [salt.state       ][INFO    ][24384] Running state [python -c "import yaml; stream = file('/etc/salt/grains.d/dns_records', 'r'); yaml.load(stream); stream.close()"] at time 08:48:41.843115
2017-10-29 08:48:41,843 [salt.state       ][INFO    ][24384] Executing state cmd.wait for python -c "import yaml; stream = file('/etc/salt/grains.d/dns_records', 'r'); yaml.load(stream); stream.close()"
2017-10-29 08:48:41,844 [salt.state       ][INFO    ][24384] No changes made for python -c "import yaml; stream = file('/etc/salt/grains.d/dns_records', 'r'); yaml.load(stream); stream.close()"
2017-10-29 08:48:41,844 [salt.state       ][INFO    ][24384] Completed state [python -c "import yaml; stream = file('/etc/salt/grains.d/dns_records', 'r'); yaml.load(stream); stream.close()"] at time 08:48:41.843686 duration_in_ms=0.571
2017-10-29 08:48:41,844 [salt.state       ][INFO    ][24384] Running state [/etc/salt/grains.d/salt] at time 08:48:41.844013
2017-10-29 08:48:41,844 [salt.state       ][INFO    ][24384] Executing state file.managed for /etc/salt/grains.d/salt
2017-10-29 08:48:41,866 [salt.state       ][INFO    ][24384] File /etc/salt/grains.d/salt is in the correct state
2017-10-29 08:48:41,866 [salt.state       ][INFO    ][24384] Completed state [/etc/salt/grains.d/salt] at time 08:48:41.865949 duration_in_ms=21.936
2017-10-29 08:48:41,867 [salt.state       ][INFO    ][24384] Running state [python -c "import yaml; stream = file('/etc/salt/grains.d/salt', 'r'); yaml.load(stream); stream.close()"] at time 08:48:41.866569
2017-10-29 08:48:41,867 [salt.state       ][INFO    ][24384] Executing state cmd.wait for python -c "import yaml; stream = file('/etc/salt/grains.d/salt', 'r'); yaml.load(stream); stream.close()"
2017-10-29 08:48:41,867 [salt.state       ][INFO    ][24384] No changes made for python -c "import yaml; stream = file('/etc/salt/grains.d/salt', 'r'); yaml.load(stream); stream.close()"
2017-10-29 08:48:41,867 [salt.state       ][INFO    ][24384] Completed state [python -c "import yaml; stream = file('/etc/salt/grains.d/salt', 'r'); yaml.load(stream); stream.close()"] at time 08:48:41.867152 duration_in_ms=0.584
2017-10-29 08:48:41,868 [salt.state       ][INFO    ][24384] Running state [cat /etc/salt/grains.d/* > /etc/salt/grains] at time 08:48:41.868416
2017-10-29 08:48:41,869 [salt.state       ][INFO    ][24384] Executing state cmd.wait for cat /etc/salt/grains.d/* > /etc/salt/grains
2017-10-29 08:48:41,869 [salt.state       ][INFO    ][24384] No changes made for cat /etc/salt/grains.d/* > /etc/salt/grains
2017-10-29 08:48:41,869 [salt.state       ][INFO    ][24384] Completed state [cat /etc/salt/grains.d/* > /etc/salt/grains] at time 08:48:41.869002 duration_in_ms=0.587
2017-10-29 08:48:41,869 [salt.state       ][INFO    ][24384] Running state [mine.update] at time 08:48:41.869443
2017-10-29 08:48:41,870 [salt.state       ][INFO    ][24384] Executing state module.wait for mine.update
2017-10-29 08:48:41,870 [salt.state       ][INFO    ][24384] No changes made for mine.update
2017-10-29 08:48:41,870 [salt.state       ][INFO    ][24384] Completed state [mine.update] at time 08:48:41.869992 duration_in_ms=0.549
2017-10-29 08:48:41,870 [salt.state       ][INFO    ][24384] Running state [ca-certificates] at time 08:48:41.870170
2017-10-29 08:48:41,870 [salt.state       ][INFO    ][24384] Executing state pkg.installed for ca-certificates
2017-10-29 08:48:41,873 [salt.state       ][INFO    ][24384] Package ca-certificates is already installed
2017-10-29 08:48:41,874 [salt.state       ][INFO    ][24384] Completed state [ca-certificates] at time 08:48:41.873623 duration_in_ms=3.452
2017-10-29 08:48:41,874 [salt.state       ][INFO    ][24384] Running state [update-ca-certificates] at time 08:48:41.874085
2017-10-29 08:48:41,874 [salt.state       ][INFO    ][24384] Executing state cmd.wait for update-ca-certificates
2017-10-29 08:48:41,875 [salt.state       ][INFO    ][24384] No changes made for update-ca-certificates
2017-10-29 08:48:41,875 [salt.state       ][INFO    ][24384] Completed state [update-ca-certificates] at time 08:48:41.874648 duration_in_ms=0.562
2017-10-29 08:48:41,875 [salt.state       ][INFO    ][24384] Running state [libvirt-dev] at time 08:48:41.874823
2017-10-29 08:48:41,875 [salt.state       ][INFO    ][24384] Executing state pkg.installed for libvirt-dev
2017-10-29 08:48:41,878 [salt.state       ][INFO    ][24384] Package libvirt-dev is already installed
2017-10-29 08:48:41,878 [salt.state       ][INFO    ][24384] Completed state [libvirt-dev] at time 08:48:41.877830 duration_in_ms=3.006
2017-10-29 08:48:41,878 [salt.state       ][INFO    ][24384] Running state [pkg-config] at time 08:48:41.878017
2017-10-29 08:48:41,878 [salt.state       ][INFO    ][24384] Executing state pkg.installed for pkg-config
2017-10-29 08:48:41,881 [salt.state       ][INFO    ][24384] Package pkg-config is already installed
2017-10-29 08:48:41,881 [salt.state       ][INFO    ][24384] Completed state [pkg-config] at time 08:48:41.881013 duration_in_ms=2.995
2017-10-29 08:48:41,881 [salt.state       ][INFO    ][24384] Running state [virtng.init] at time 08:48:41.881203
2017-10-29 08:48:41,881 [salt.state       ][INFO    ][24384] Executing state module.run for virtng.init
2017-10-29 08:48:41,953 [salt.loaded.int.module.cmdmod][INFO    ][24384] Executing command ['git', '--version'] in directory '/root'
2017-10-29 08:48:42,053 [salt.loaded.int.module.cmdmod][INFO    ][24384] Executing command 'virsh list --all --name| grep -E "^prx01.baremetal-mcp-ocata-odl-ha.local$"' in directory '/root'
2017-10-29 08:48:42,073 [salt.state       ][INFO    ][24384] unless execution succeeded
2017-10-29 08:48:42,085 [salt.state       ][INFO    ][24384] Completed state [virtng.init] at time 08:48:42.084542 duration_in_ms=203.338
2017-10-29 08:48:42,085 [salt.state       ][INFO    ][24384] Running state [virt.set_autostart] at time 08:48:42.084860
2017-10-29 08:48:42,085 [salt.state       ][INFO    ][24384] Executing state module.run for virt.set_autostart
2017-10-29 08:48:42,087 [salt.loaded.int.module.cmdmod][INFO    ][24384] Executing command 'virsh list --autostart --name| grep -E "^prx01.baremetal-mcp-ocata-odl-ha.local$"' in directory '/root'
2017-10-29 08:48:42,104 [salt.state       ][INFO    ][24384] unless execution succeeded
2017-10-29 08:48:42,104 [salt.state       ][INFO    ][24384] Completed state [virt.set_autostart] at time 08:48:42.104407 duration_in_ms=19.547
2017-10-29 08:48:42,105 [salt.state       ][INFO    ][24384] Running state [virtng.init] at time 08:48:42.104654
2017-10-29 08:48:42,105 [salt.state       ][INFO    ][24384] Executing state module.run for virtng.init
2017-10-29 08:48:42,107 [salt.loaded.int.module.cmdmod][INFO    ][24384] Executing command 'virsh list --all --name| grep -E "^ctl01.baremetal-mcp-ocata-odl-ha.local$"' in directory '/root'
2017-10-29 08:48:42,124 [salt.state       ][INFO    ][24384] unless execution succeeded
2017-10-29 08:48:42,124 [salt.state       ][INFO    ][24384] Completed state [virtng.init] at time 08:48:42.123754 duration_in_ms=19.1
2017-10-29 08:48:42,124 [salt.state       ][INFO    ][24384] Running state [virt.set_autostart] at time 08:48:42.124027
2017-10-29 08:48:42,124 [salt.state       ][INFO    ][24384] Executing state module.run for virt.set_autostart
2017-10-29 08:48:42,126 [salt.loaded.int.module.cmdmod][INFO    ][24384] Executing command 'virsh list --autostart --name| grep -E "^ctl01.baremetal-mcp-ocata-odl-ha.local$"' in directory '/root'
2017-10-29 08:48:42,142 [salt.state       ][INFO    ][24384] unless execution succeeded
2017-10-29 08:48:42,142 [salt.state       ][INFO    ][24384] Completed state [virt.set_autostart] at time 08:48:42.141946 duration_in_ms=17.918
2017-10-29 08:48:42,142 [salt.state       ][INFO    ][24384] Running state [virtng.init] at time 08:48:42.142180
2017-10-29 08:48:42,142 [salt.state       ][INFO    ][24384] Executing state module.run for virtng.init
2017-10-29 08:48:42,144 [salt.loaded.int.module.cmdmod][INFO    ][24384] Executing command 'virsh list --all --name| grep -E "^mdb01.baremetal-mcp-ocata-odl-ha.local$"' in directory '/root'
2017-10-29 08:48:42,160 [salt.state       ][INFO    ][24384] unless execution succeeded
2017-10-29 08:48:42,160 [salt.state       ][INFO    ][24384] Completed state [virtng.init] at time 08:48:42.159902 duration_in_ms=17.721
2017-10-29 08:48:42,160 [salt.state       ][INFO    ][24384] Running state [virt.set_autostart] at time 08:48:42.160135
2017-10-29 08:48:42,160 [salt.state       ][INFO    ][24384] Executing state module.run for virt.set_autostart
2017-10-29 08:48:42,162 [salt.loaded.int.module.cmdmod][INFO    ][24384] Executing command 'virsh list --autostart --name| grep -E "^mdb01.baremetal-mcp-ocata-odl-ha.local$"' in directory '/root'
2017-10-29 08:48:42,177 [salt.state       ][INFO    ][24384] unless execution succeeded
2017-10-29 08:48:42,178 [salt.state       ][INFO    ][24384] Completed state [virt.set_autostart] at time 08:48:42.177498 duration_in_ms=17.363
2017-10-29 08:48:42,178 [salt.state       ][INFO    ][24384] Running state [virtng.init] at time 08:48:42.177723
2017-10-29 08:48:42,178 [salt.state       ][INFO    ][24384] Executing state module.run for virtng.init
2017-10-29 08:48:42,180 [salt.loaded.int.module.cmdmod][INFO    ][24384] Executing command 'virsh list --all --name| grep -E "^msg01.baremetal-mcp-ocata-odl-ha.local$"' in directory '/root'
2017-10-29 08:48:42,195 [salt.state       ][INFO    ][24384] unless execution succeeded
2017-10-29 08:48:42,195 [salt.state       ][INFO    ][24384] Completed state [virtng.init] at time 08:48:42.194960 duration_in_ms=17.237
2017-10-29 08:48:42,195 [salt.state       ][INFO    ][24384] Running state [virt.set_autostart] at time 08:48:42.195177
2017-10-29 08:48:42,195 [salt.state       ][INFO    ][24384] Executing state module.run for virt.set_autostart
2017-10-29 08:48:42,197 [salt.loaded.int.module.cmdmod][INFO    ][24384] Executing command 'virsh list --autostart --name| grep -E "^msg01.baremetal-mcp-ocata-odl-ha.local$"' in directory '/root'
2017-10-29 08:48:42,211 [salt.state       ][INFO    ][24384] unless execution succeeded
2017-10-29 08:48:42,211 [salt.state       ][INFO    ][24384] Completed state [virt.set_autostart] at time 08:48:42.211094 duration_in_ms=15.917
2017-10-29 08:48:42,211 [salt.state       ][INFO    ][24384] Running state [virtng.init] at time 08:48:42.211321
2017-10-29 08:48:42,212 [salt.state       ][INFO    ][24384] Executing state module.run for virtng.init
2017-10-29 08:48:42,213 [salt.loaded.int.module.cmdmod][INFO    ][24384] Executing command 'virsh list --all --name| grep -E "^dbs01.baremetal-mcp-ocata-odl-ha.local$"' in directory '/root'
2017-10-29 08:48:42,227 [salt.state       ][INFO    ][24384] unless execution succeeded
2017-10-29 08:48:42,228 [salt.state       ][INFO    ][24384] Completed state [virtng.init] at time 08:48:42.227564 duration_in_ms=16.243
2017-10-29 08:48:42,228 [salt.state       ][INFO    ][24384] Running state [virt.set_autostart] at time 08:48:42.227792
2017-10-29 08:48:42,228 [salt.state       ][INFO    ][24384] Executing state module.run for virt.set_autostart
2017-10-29 08:48:42,230 [salt.loaded.int.module.cmdmod][INFO    ][24384] Executing command 'virsh list --autostart --name| grep -E "^dbs01.baremetal-mcp-ocata-odl-ha.local$"' in directory '/root'
2017-10-29 08:48:42,243 [salt.state       ][INFO    ][24384] unless execution succeeded
2017-10-29 08:48:42,263 [salt.state       ][INFO    ][24384] Completed state [virt.set_autostart] at time 08:48:42.262514 duration_in_ms=34.72
2017-10-29 08:48:42,265 [salt.minion      ][INFO    ][24384] Returning information for job: 20171029084836969717
2017-10-29 08:48:44,742 [salt.minion      ][INFO    ][24018] User sudo_ubuntu Executing command pillar.get with jid 20171029084844732415
2017-10-29 08:48:44,755 [salt.minion      ][INFO    ][24479] Starting a new job with PID 24479
2017-10-29 08:48:44,759 [salt.minion      ][INFO    ][24479] Returning information for job: 20171029084844732415
2017-10-29 08:49:28,468 [salt.minion      ][INFO    ][24018] User sudo_ubuntu Executing command saltutil.sync_all with jid 20171029084928450181
2017-10-29 08:49:28,490 [salt.minion      ][INFO    ][24493] Starting a new job with PID 24493
2017-10-29 08:49:31,004 [salt.state       ][INFO    ][24493] Loading fresh modules for state activity
2017-10-29 08:49:31,606 [salt.state       ][ERROR   ][24493] No contents found in top file
2017-10-29 08:49:31,607 [salt.utils.extmods][INFO    ][24493] Creating module dir '/var/cache/salt/minion/extmods/beacons'
2017-10-29 08:49:31,610 [salt.utils.extmods][INFO    ][24493] Syncing beacons for environment 'base'
2017-10-29 08:49:31,610 [salt.utils.extmods][INFO    ][24493] Loading cache from salt://_beacons, for base)
2017-10-29 08:49:31,610 [salt.fileclient  ][INFO    ][24493] Caching directory '_beacons/' for environment 'base'
2017-10-29 08:49:31,648 [salt.utils.extmods][INFO    ][24493] Syncing modules for environment 'base'
2017-10-29 08:49:31,657 [salt.utils.extmods][INFO    ][24493] Loading cache from salt://_modules, for base)
2017-10-29 08:49:31,657 [salt.fileclient  ][INFO    ][24493] Caching directory '_modules/' for environment 'base'
2017-10-29 08:49:31,700 [salt.fileclient  ][INFO    ][24493] Fetching file from saltenv 'base', ** done ** '_modules/ceph_ng.py'
2017-10-29 08:49:31,708 [salt.fileclient  ][INFO    ][24493] Fetching file from saltenv 'base', ** done ** '_modules/cinderng.py'
2017-10-29 08:49:31,719 [salt.fileclient  ][INFO    ][24493] Fetching file from saltenv 'base', ** done ** '_modules/contrail.py'
2017-10-29 08:49:31,774 [salt.fileclient  ][INFO    ][24493] Fetching file from saltenv 'base', ** done ** '_modules/creds.py'
2017-10-29 08:49:31,803 [salt.fileclient  ][INFO    ][24493] Fetching file from saltenv 'base', ** done ** '_modules/devops_utils.py'
2017-10-29 08:49:31,832 [salt.fileclient  ][INFO    ][24493] Fetching file from saltenv 'base', ** done ** '_modules/encode_json.py'
2017-10-29 08:49:31,850 [salt.fileclient  ][INFO    ][24493] Fetching file from saltenv 'base', ** done ** '_modules/gerrit.py'
2017-10-29 08:49:31,879 [salt.fileclient  ][INFO    ][24493] Fetching file from saltenv 'base', ** done ** '_modules/glanceng.py'
2017-10-29 08:49:31,894 [salt.fileclient  ][INFO    ][24493] Fetching file from saltenv 'base', ** done ** '_modules/heat.py'
2017-10-29 08:49:31,930 [salt.fileclient  ][INFO    ][24493] Fetching file from saltenv 'base', ** done ** '_modules/heka_alarming.py'
2017-10-29 08:49:31,973 [salt.fileclient  ][INFO    ][24493] Fetching file from saltenv 'base', ** done ** '_modules/helm.py'
2017-10-29 08:49:32,012 [salt.fileclient  ][INFO    ][24493] Fetching file from saltenv 'base', ** done ** '_modules/jenkins_common.py'
2017-10-29 08:49:32,023 [salt.fileclient  ][INFO    ][24493] Fetching file from saltenv 'base', ** done ** '_modules/keystone_policy.py'
2017-10-29 08:49:32,042 [salt.fileclient  ][INFO    ][24493] Fetching file from saltenv 'base', ** done ** '_modules/linux_hosts.py'
2017-10-29 08:49:32,055 [salt.fileclient  ][INFO    ][24493] Fetching file from saltenv 'base', ** done ** '_modules/linux_netlink.py'
2017-10-29 08:49:32,079 [salt.fileclient  ][INFO    ][24493] Fetching file from saltenv 'base', ** done ** '_modules/maas.py'
2017-10-29 08:49:32,116 [salt.fileclient  ][INFO    ][24493] Fetching file from saltenv 'base', ** done ** '_modules/maas_client.py'
2017-10-29 08:49:32,129 [salt.fileclient  ][INFO    ][24493] Fetching file from saltenv 'base', ** done ** '_modules/multipart.py'
2017-10-29 08:49:32,136 [salt.fileclient  ][INFO    ][24493] Fetching file from saltenv 'base', ** done ** '_modules/nagios_alarming.py'
2017-10-29 08:49:32,162 [salt.fileclient  ][INFO    ][24493] Fetching file from saltenv 'base', ** done ** '_modules/neutronng.py'
2017-10-29 08:49:32,194 [salt.fileclient  ][INFO    ][24493] Fetching file from saltenv 'base', ** done ** '_modules/novang.py'
2017-10-29 08:49:32,218 [salt.fileclient  ][INFO    ][24493] Fetching file from saltenv 'base', ** done ** '_modules/reclass.py'
2017-10-29 08:49:32,230 [salt.fileclient  ][INFO    ][24493] Fetching file from saltenv 'base', ** done ** '_modules/rsyslog_util.py'
2017-10-29 08:49:32,245 [salt.fileclient  ][INFO    ][24493] Fetching file from saltenv 'base', ** done ** '_modules/rundeck.py'
2017-10-29 08:49:32,279 [salt.fileclient  ][INFO    ][24493] Fetching file from saltenv 'base', ** done ** '_modules/saltkey.py'
2017-10-29 08:49:32,296 [salt.fileclient  ][INFO    ][24493] Fetching file from saltenv 'base', ** done ** '_modules/saltresource.py'
2017-10-29 08:49:32,311 [salt.fileclient  ][INFO    ][24493] Fetching file from saltenv 'base', ** done ** '_modules/seedng.py'
2017-10-29 08:49:32,374 [salt.fileclient  ][INFO    ][24493] Fetching file from saltenv 'base', ** done ** '_modules/testing/credentials.py'
2017-10-29 08:49:32,388 [salt.fileclient  ][INFO    ][24493] Fetching file from saltenv 'base', ** done ** '_modules/testing/django.py'
2017-10-29 08:49:32,444 [salt.fileclient  ][INFO    ][24493] Fetching file from saltenv 'base', ** done ** '_modules/testing/django_client_proxy.py'
2017-10-29 08:49:32,452 [salt.fileclient  ][INFO    ][24493] Fetching file from saltenv 'base', ** done ** '_modules/utils.py'
2017-10-29 08:49:32,471 [salt.fileclient  ][INFO    ][24493] Fetching file from saltenv 'base', ** done ** '_modules/virtng.py'
2017-10-29 08:49:32,473 [salt.utils.extmods][INFO    ][24493] Copying '/var/cache/salt/minion/files/base/_modules/__init__.py' to '/var/cache/salt/minion/extmods/modules/__init__.py'
2017-10-29 08:49:32,474 [salt.utils.extmods][INFO    ][24493] Copying '/var/cache/salt/minion/files/base/_modules/ceph_ng.py' to '/var/cache/salt/minion/extmods/modules/ceph_ng.py'
2017-10-29 08:49:32,474 [salt.utils.extmods][INFO    ][24493] Copying '/var/cache/salt/minion/files/base/_modules/cinderng.py' to '/var/cache/salt/minion/extmods/modules/cinderng.py'
2017-10-29 08:49:32,474 [salt.utils.extmods][INFO    ][24493] Copying '/var/cache/salt/minion/files/base/_modules/contrail.py' to '/var/cache/salt/minion/extmods/modules/contrail.py'
2017-10-29 08:49:32,474 [salt.utils.extmods][INFO    ][24493] Copying '/var/cache/salt/minion/files/base/_modules/creds.py' to '/var/cache/salt/minion/extmods/modules/creds.py'
2017-10-29 08:49:32,475 [salt.utils.extmods][INFO    ][24493] Copying '/var/cache/salt/minion/files/base/_modules/devops_utils.py' to '/var/cache/salt/minion/extmods/modules/devops_utils.py'
2017-10-29 08:49:32,475 [salt.utils.extmods][INFO    ][24493] Copying '/var/cache/salt/minion/files/base/_modules/encode_json.py' to '/var/cache/salt/minion/extmods/modules/encode_json.py'
2017-10-29 08:49:32,475 [salt.utils.extmods][INFO    ][24493] Copying '/var/cache/salt/minion/files/base/_modules/gerrit.py' to '/var/cache/salt/minion/extmods/modules/gerrit.py'
2017-10-29 08:49:32,475 [salt.utils.extmods][INFO    ][24493] Copying '/var/cache/salt/minion/files/base/_modules/glanceng.py' to '/var/cache/salt/minion/extmods/modules/glanceng.py'
2017-10-29 08:49:32,475 [salt.utils.extmods][INFO    ][24493] Copying '/var/cache/salt/minion/files/base/_modules/heat.py' to '/var/cache/salt/minion/extmods/modules/heat.py'
2017-10-29 08:49:32,476 [salt.utils.extmods][INFO    ][24493] Copying '/var/cache/salt/minion/files/base/_modules/heka_alarming.py' to '/var/cache/salt/minion/extmods/modules/heka_alarming.py'
2017-10-29 08:49:32,476 [salt.utils.extmods][INFO    ][24493] Copying '/var/cache/salt/minion/files/base/_modules/helm.py' to '/var/cache/salt/minion/extmods/modules/helm.py'
2017-10-29 08:49:32,476 [salt.utils.extmods][INFO    ][24493] Copying '/var/cache/salt/minion/files/base/_modules/jenkins_common.py' to '/var/cache/salt/minion/extmods/modules/jenkins_common.py'
2017-10-29 08:49:32,476 [salt.utils.extmods][INFO    ][24493] Copying '/var/cache/salt/minion/files/base/_modules/keystone_policy.py' to '/var/cache/salt/minion/extmods/modules/keystone_policy.py'
2017-10-29 08:49:32,476 [salt.utils.extmods][INFO    ][24493] Copying '/var/cache/salt/minion/files/base/_modules/linux_hosts.py' to '/var/cache/salt/minion/extmods/modules/linux_hosts.py'
2017-10-29 08:49:32,477 [salt.utils.extmods][INFO    ][24493] Copying '/var/cache/salt/minion/files/base/_modules/linux_netlink.py' to '/var/cache/salt/minion/extmods/modules/linux_netlink.py'
2017-10-29 08:49:32,477 [salt.utils.extmods][INFO    ][24493] Copying '/var/cache/salt/minion/files/base/_modules/maas.py' to '/var/cache/salt/minion/extmods/modules/maas.py'
2017-10-29 08:49:32,477 [salt.utils.extmods][INFO    ][24493] Copying '/var/cache/salt/minion/files/base/_modules/maas_client.py' to '/var/cache/salt/minion/extmods/modules/maas_client.py'
2017-10-29 08:49:32,477 [salt.utils.extmods][INFO    ][24493] Copying '/var/cache/salt/minion/files/base/_modules/multipart.py' to '/var/cache/salt/minion/extmods/modules/multipart.py'
2017-10-29 08:49:32,477 [salt.utils.extmods][INFO    ][24493] Copying '/var/cache/salt/minion/files/base/_modules/nagios_alarming.py' to '/var/cache/salt/minion/extmods/modules/nagios_alarming.py'
2017-10-29 08:49:32,478 [salt.utils.extmods][INFO    ][24493] Copying '/var/cache/salt/minion/files/base/_modules/neutronng.py' to '/var/cache/salt/minion/extmods/modules/neutronng.py'
2017-10-29 08:49:32,478 [salt.utils.extmods][INFO    ][24493] Copying '/var/cache/salt/minion/files/base/_modules/novang.py' to '/var/cache/salt/minion/extmods/modules/novang.py'
2017-10-29 08:49:32,478 [salt.utils.extmods][INFO    ][24493] Copying '/var/cache/salt/minion/files/base/_modules/reclass.py' to '/var/cache/salt/minion/extmods/modules/reclass.py'
2017-10-29 08:49:32,478 [salt.utils.extmods][INFO    ][24493] Copying '/var/cache/salt/minion/files/base/_modules/rsyslog_util.py' to '/var/cache/salt/minion/extmods/modules/rsyslog_util.py'
2017-10-29 08:49:32,479 [salt.utils.extmods][INFO    ][24493] Copying '/var/cache/salt/minion/files/base/_modules/rundeck.py' to '/var/cache/salt/minion/extmods/modules/rundeck.py'
2017-10-29 08:49:32,479 [salt.utils.extmods][INFO    ][24493] Copying '/var/cache/salt/minion/files/base/_modules/saltkey.py' to '/var/cache/salt/minion/extmods/modules/saltkey.py'
2017-10-29 08:49:32,479 [salt.utils.extmods][INFO    ][24493] Copying '/var/cache/salt/minion/files/base/_modules/saltresource.py' to '/var/cache/salt/minion/extmods/modules/saltresource.py'
2017-10-29 08:49:32,479 [salt.utils.extmods][INFO    ][24493] Copying '/var/cache/salt/minion/files/base/_modules/seedng.py' to '/var/cache/salt/minion/extmods/modules/seedng.py'
2017-10-29 08:49:32,479 [salt.utils.extmods][INFO    ][24493] Copying '/var/cache/salt/minion/files/base/_modules/testing/__init__.py' to '/var/cache/salt/minion/extmods/modules/testing/__init__.py'
2017-10-29 08:49:32,480 [salt.utils.extmods][INFO    ][24493] Copying '/var/cache/salt/minion/files/base/_modules/testing/credentials.py' to '/var/cache/salt/minion/extmods/modules/testing/credentials.py'
2017-10-29 08:49:32,480 [salt.utils.extmods][INFO    ][24493] Copying '/var/cache/salt/minion/files/base/_modules/testing/django.py' to '/var/cache/salt/minion/extmods/modules/testing/django.py'
2017-10-29 08:49:32,480 [salt.utils.extmods][INFO    ][24493] 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-10-29 08:49:32,480 [salt.utils.extmods][INFO    ][24493] Copying '/var/cache/salt/minion/files/base/_modules/utils.py' to '/var/cache/salt/minion/extmods/modules/utils.py'
2017-10-29 08:49:32,480 [salt.utils.extmods][INFO    ][24493] Copying '/var/cache/salt/minion/files/base/_modules/virtng.py' to '/var/cache/salt/minion/extmods/modules/virtng.py'
2017-10-29 08:49:32,485 [salt.utils.extmods][INFO    ][24493] Syncing states for environment 'base'
2017-10-29 08:49:32,486 [salt.utils.extmods][INFO    ][24493] Loading cache from salt://_states, for base)
2017-10-29 08:49:32,486 [salt.fileclient  ][INFO    ][24493] Caching directory '_states/' for environment 'base'
2017-10-29 08:49:32,550 [salt.fileclient  ][INFO    ][24493] Fetching file from saltenv 'base', ** done ** '_states/cinderng.py'
2017-10-29 08:49:32,557 [salt.fileclient  ][INFO    ][24493] Fetching file from saltenv 'base', ** done ** '_states/contrail.py'
2017-10-29 08:49:32,568 [salt.fileclient  ][INFO    ][24493] Fetching file from saltenv 'base', ** done ** '_states/gerrit.py'
2017-10-29 08:49:32,638 [salt.fileclient  ][INFO    ][24493] Fetching file from saltenv 'base', ** done ** '_states/glanceng.py'
2017-10-29 08:49:32,648 [salt.fileclient  ][INFO    ][24493] Fetching file from saltenv 'base', ** done ** '_states/grafana3_dashboard.py'
2017-10-29 08:49:32,668 [salt.fileclient  ][INFO    ][24493] Fetching file from saltenv 'base', ** done ** '_states/grafana3_datasource.py'
2017-10-29 08:49:32,704 [salt.fileclient  ][INFO    ][24493] Fetching file from saltenv 'base', ** done ** '_states/heat.py'
2017-10-29 08:49:32,712 [salt.fileclient  ][INFO    ][24493] Fetching file from saltenv 'base', ** done ** '_states/helm_release.py'
2017-10-29 08:49:32,757 [salt.fileclient  ][INFO    ][24493] Fetching file from saltenv 'base', ** done ** '_states/jenkins_approval.py'
2017-10-29 08:49:32,787 [salt.fileclient  ][INFO    ][24493] Fetching file from saltenv 'base', ** done ** '_states/jenkins_artifactory.py'
2017-10-29 08:49:32,846 [salt.fileclient  ][INFO    ][24493] Fetching file from saltenv 'base', ** done ** '_states/jenkins_credential.py'
2017-10-29 08:49:32,882 [salt.fileclient  ][INFO    ][24493] Fetching file from saltenv 'base', ** done ** '_states/jenkins_job.py'
2017-10-29 08:49:32,893 [salt.fileclient  ][INFO    ][24493] Fetching file from saltenv 'base', ** done ** '_states/jenkins_lib.py'
2017-10-29 08:49:32,941 [salt.fileclient  ][INFO    ][24493] Fetching file from saltenv 'base', ** done ** '_states/jenkins_node.py'
2017-10-29 08:49:32,949 [salt.fileclient  ][INFO    ][24493] Fetching file from saltenv 'base', ** done ** '_states/jenkins_plugin.py'
2017-10-29 08:49:32,985 [salt.fileclient  ][INFO    ][24493] Fetching file from saltenv 'base', ** done ** '_states/jenkins_security.py'
2017-10-29 08:49:33,002 [salt.fileclient  ][INFO    ][24493] Fetching file from saltenv 'base', ** done ** '_states/jenkins_slack.py'
2017-10-29 08:49:33,010 [salt.fileclient  ][INFO    ][24493] Fetching file from saltenv 'base', ** done ** '_states/jenkins_smtp.py'
2017-10-29 08:49:33,036 [salt.fileclient  ][INFO    ][24493] Fetching file from saltenv 'base', ** done ** '_states/jenkins_theme.py'
2017-10-29 08:49:33,059 [salt.fileclient  ][INFO    ][24493] Fetching file from saltenv 'base', ** done ** '_states/jenkins_user.py'
2017-10-29 08:49:33,080 [salt.fileclient  ][INFO    ][24493] Fetching file from saltenv 'base', ** done ** '_states/jenkins_view.py'
2017-10-29 08:49:33,113 [salt.fileclient  ][INFO    ][24493] Fetching file from saltenv 'base', ** done ** '_states/keystone_policy.py'
2017-10-29 08:49:33,132 [salt.fileclient  ][INFO    ][24493] Fetching file from saltenv 'base', ** done ** '_states/kibana_object.py'
2017-10-29 08:49:33,185 [salt.fileclient  ][INFO    ][24493] Fetching file from saltenv 'base', ** done ** '_states/neutronng.py'
2017-10-29 08:49:33,195 [salt.fileclient  ][INFO    ][24493] Fetching file from saltenv 'base', ** done ** '_states/novang.py'
2017-10-29 08:49:33,219 [salt.fileclient  ][INFO    ][24493] Fetching file from saltenv 'base', ** done ** '_states/reclass.py'
2017-10-29 08:49:33,228 [salt.fileclient  ][INFO    ][24493] Fetching file from saltenv 'base', ** done ** '_states/rundeck_project.py'
2017-10-29 08:49:33,251 [salt.fileclient  ][INFO    ][24493] Fetching file from saltenv 'base', ** done ** '_states/rundeck_scm.py'
2017-10-29 08:49:33,272 [salt.fileclient  ][INFO    ][24493] Fetching file from saltenv 'base', ** done ** '_states/rundeck_secret.py'
2017-10-29 08:49:33,275 [salt.utils.extmods][INFO    ][24493] Copying '/var/cache/salt/minion/files/base/_states/cinderng.py' to '/var/cache/salt/minion/extmods/states/cinderng.py'
2017-10-29 08:49:33,275 [salt.utils.extmods][INFO    ][24493] Copying '/var/cache/salt/minion/files/base/_states/contrail.py' to '/var/cache/salt/minion/extmods/states/contrail.py'
2017-10-29 08:49:33,276 [salt.utils.extmods][INFO    ][24493] Copying '/var/cache/salt/minion/files/base/_states/gerrit.py' to '/var/cache/salt/minion/extmods/states/gerrit.py'
2017-10-29 08:49:33,276 [salt.utils.extmods][INFO    ][24493] Copying '/var/cache/salt/minion/files/base/_states/glanceng.py' to '/var/cache/salt/minion/extmods/states/glanceng.py'
2017-10-29 08:49:33,276 [salt.utils.extmods][INFO    ][24493] Copying '/var/cache/salt/minion/files/base/_states/grafana3_dashboard.py' to '/var/cache/salt/minion/extmods/states/grafana3_dashboard.py'
2017-10-29 08:49:33,277 [salt.utils.extmods][INFO    ][24493] Copying '/var/cache/salt/minion/files/base/_states/grafana3_datasource.py' to '/var/cache/salt/minion/extmods/states/grafana3_datasource.py'
2017-10-29 08:49:33,277 [salt.utils.extmods][INFO    ][24493] Copying '/var/cache/salt/minion/files/base/_states/heat.py' to '/var/cache/salt/minion/extmods/states/heat.py'
2017-10-29 08:49:33,277 [salt.utils.extmods][INFO    ][24493] Copying '/var/cache/salt/minion/files/base/_states/helm_release.py' to '/var/cache/salt/minion/extmods/states/helm_release.py'
2017-10-29 08:49:33,277 [salt.utils.extmods][INFO    ][24493] Copying '/var/cache/salt/minion/files/base/_states/jenkins_approval.py' to '/var/cache/salt/minion/extmods/states/jenkins_approval.py'
2017-10-29 08:49:33,278 [salt.utils.extmods][INFO    ][24493] Copying '/var/cache/salt/minion/files/base/_states/jenkins_artifactory.py' to '/var/cache/salt/minion/extmods/states/jenkins_artifactory.py'
2017-10-29 08:49:33,278 [salt.utils.extmods][INFO    ][24493] Copying '/var/cache/salt/minion/files/base/_states/jenkins_credential.py' to '/var/cache/salt/minion/extmods/states/jenkins_credential.py'
2017-10-29 08:49:33,278 [salt.utils.extmods][INFO    ][24493] Copying '/var/cache/salt/minion/files/base/_states/jenkins_job.py' to '/var/cache/salt/minion/extmods/states/jenkins_job.py'
2017-10-29 08:49:33,278 [salt.utils.extmods][INFO    ][24493] Copying '/var/cache/salt/minion/files/base/_states/jenkins_lib.py' to '/var/cache/salt/minion/extmods/states/jenkins_lib.py'
2017-10-29 08:49:33,279 [salt.utils.extmods][INFO    ][24493] Copying '/var/cache/salt/minion/files/base/_states/jenkins_node.py' to '/var/cache/salt/minion/extmods/states/jenkins_node.py'
2017-10-29 08:49:33,279 [salt.utils.extmods][INFO    ][24493] Copying '/var/cache/salt/minion/files/base/_states/jenkins_plugin.py' to '/var/cache/salt/minion/extmods/states/jenkins_plugin.py'
2017-10-29 08:49:33,279 [salt.utils.extmods][INFO    ][24493] Copying '/var/cache/salt/minion/files/base/_states/jenkins_security.py' to '/var/cache/salt/minion/extmods/states/jenkins_security.py'
2017-10-29 08:49:33,279 [salt.utils.extmods][INFO    ][24493] Copying '/var/cache/salt/minion/files/base/_states/jenkins_slack.py' to '/var/cache/salt/minion/extmods/states/jenkins_slack.py'
2017-10-29 08:49:33,280 [salt.utils.extmods][INFO    ][24493] Copying '/var/cache/salt/minion/files/base/_states/jenkins_smtp.py' to '/var/cache/salt/minion/extmods/states/jenkins_smtp.py'
2017-10-29 08:49:33,280 [salt.utils.extmods][INFO    ][24493] Copying '/var/cache/salt/minion/files/base/_states/jenkins_theme.py' to '/var/cache/salt/minion/extmods/states/jenkins_theme.py'
2017-10-29 08:49:33,280 [salt.utils.extmods][INFO    ][24493] Copying '/var/cache/salt/minion/files/base/_states/jenkins_user.py' to '/var/cache/salt/minion/extmods/states/jenkins_user.py'
2017-10-29 08:49:33,280 [salt.utils.extmods][INFO    ][24493] Copying '/var/cache/salt/minion/files/base/_states/jenkins_view.py' to '/var/cache/salt/minion/extmods/states/jenkins_view.py'
2017-10-29 08:49:33,281 [salt.utils.extmods][INFO    ][24493] Copying '/var/cache/salt/minion/files/base/_states/keystone_policy.py' to '/var/cache/salt/minion/extmods/states/keystone_policy.py'
2017-10-29 08:49:33,281 [salt.utils.extmods][INFO    ][24493] Copying '/var/cache/salt/minion/files/base/_states/kibana_object.py' to '/var/cache/salt/minion/extmods/states/kibana_object.py'
2017-10-29 08:49:33,281 [salt.utils.extmods][INFO    ][24493] Copying '/var/cache/salt/minion/files/base/_states/maas_cluster.py' to '/var/cache/salt/minion/extmods/states/maas_cluster.py'
2017-10-29 08:49:33,281 [salt.utils.extmods][INFO    ][24493] Copying '/var/cache/salt/minion/files/base/_states/neutronng.py' to '/var/cache/salt/minion/extmods/states/neutronng.py'
2017-10-29 08:49:33,282 [salt.utils.extmods][INFO    ][24493] Copying '/var/cache/salt/minion/files/base/_states/novang.py' to '/var/cache/salt/minion/extmods/states/novang.py'
2017-10-29 08:49:33,282 [salt.utils.extmods][INFO    ][24493] Copying '/var/cache/salt/minion/files/base/_states/reclass.py' to '/var/cache/salt/minion/extmods/states/reclass.py'
2017-10-29 08:49:33,282 [salt.utils.extmods][INFO    ][24493] Copying '/var/cache/salt/minion/files/base/_states/rundeck_project.py' to '/var/cache/salt/minion/extmods/states/rundeck_project.py'
2017-10-29 08:49:33,283 [salt.utils.extmods][INFO    ][24493] Copying '/var/cache/salt/minion/files/base/_states/rundeck_scm.py' to '/var/cache/salt/minion/extmods/states/rundeck_scm.py'
2017-10-29 08:49:33,283 [salt.utils.extmods][INFO    ][24493] Copying '/var/cache/salt/minion/files/base/_states/rundeck_secret.py' to '/var/cache/salt/minion/extmods/states/rundeck_secret.py'
2017-10-29 08:49:33,285 [salt.utils.extmods][INFO    ][24493] Creating module dir '/var/cache/salt/minion/extmods/sdb'
2017-10-29 08:49:33,287 [salt.utils.extmods][INFO    ][24493] Syncing sdb for environment 'base'
2017-10-29 08:49:33,287 [salt.utils.extmods][INFO    ][24493] Loading cache from salt://_sdb, for base)
2017-10-29 08:49:33,287 [salt.fileclient  ][INFO    ][24493] Caching directory '_sdb/' for environment 'base'
2017-10-29 08:49:33,312 [salt.utils.extmods][INFO    ][24493] Syncing grains for environment 'base'
2017-10-29 08:49:33,313 [salt.utils.extmods][INFO    ][24493] Loading cache from salt://_grains, for base)
2017-10-29 08:49:33,313 [salt.fileclient  ][INFO    ][24493] Caching directory '_grains/' for environment 'base'
2017-10-29 08:49:33,364 [salt.fileclient  ][INFO    ][24493] Fetching file from saltenv 'base', ** done ** '_grains/ceilometer_policy.py'
2017-10-29 08:49:33,371 [salt.fileclient  ][INFO    ][24493] Fetching file from saltenv 'base', ** done ** '_grains/ceph.py'
2017-10-29 08:49:33,382 [salt.fileclient  ][INFO    ][24493] Fetching file from saltenv 'base', ** done ** '_grains/cinder_policy.py'
2017-10-29 08:49:33,397 [salt.fileclient  ][INFO    ][24493] Fetching file from saltenv 'base', ** done ** '_grains/docker_swarm.py'
2017-10-29 08:49:33,413 [salt.fileclient  ][INFO    ][24493] Fetching file from saltenv 'base', ** done ** '_grains/glance_policy.py'
2017-10-29 08:49:33,421 [salt.fileclient  ][INFO    ][24493] Fetching file from saltenv 'base', ** done ** '_grains/heat_policy.py'
2017-10-29 08:49:33,579 [salt.fileclient  ][INFO    ][24493] Fetching file from saltenv 'base', ** done ** '_grains/jenkins_plugins.py'
2017-10-29 08:49:33,589 [salt.fileclient  ][INFO    ][24493] Fetching file from saltenv 'base', ** done ** '_grains/keystone_policy.py'
2017-10-29 08:49:33,595 [salt.fileclient  ][INFO    ][24493] Fetching file from saltenv 'base', ** done ** '_grains/kubernetes.py'
2017-10-29 08:49:33,711 [salt.fileclient  ][INFO    ][24493] Fetching file from saltenv 'base', ** done ** '_grains/neutron_policy.py'
2017-10-29 08:49:33,964 [salt.fileclient  ][INFO    ][24493] Fetching file from saltenv 'base', ** done ** '_grains/nova_policy.py'
2017-10-29 08:49:33,971 [salt.fileclient  ][INFO    ][24493] Fetching file from saltenv 'base', ** done ** '_grains/ssh_fingerprints.py'
2017-10-29 08:49:33,974 [salt.utils.extmods][INFO    ][24493] Copying '/var/cache/salt/minion/files/base/_grains/ceilometer_policy.py' to '/var/cache/salt/minion/extmods/grains/ceilometer_policy.py'
2017-10-29 08:49:33,974 [salt.utils.extmods][INFO    ][24493] Copying '/var/cache/salt/minion/files/base/_grains/ceph.py' to '/var/cache/salt/minion/extmods/grains/ceph.py'
2017-10-29 08:49:33,974 [salt.utils.extmods][INFO    ][24493] Copying '/var/cache/salt/minion/files/base/_grains/cinder_policy.py' to '/var/cache/salt/minion/extmods/grains/cinder_policy.py'
2017-10-29 08:49:33,974 [salt.utils.extmods][INFO    ][24493] Copying '/var/cache/salt/minion/files/base/_grains/docker_swarm.py' to '/var/cache/salt/minion/extmods/grains/docker_swarm.py'
2017-10-29 08:49:33,974 [salt.utils.extmods][INFO    ][24493] Copying '/var/cache/salt/minion/files/base/_grains/glance_policy.py' to '/var/cache/salt/minion/extmods/grains/glance_policy.py'
2017-10-29 08:49:33,975 [salt.utils.extmods][INFO    ][24493] Copying '/var/cache/salt/minion/files/base/_grains/heat_policy.py' to '/var/cache/salt/minion/extmods/grains/heat_policy.py'
2017-10-29 08:49:33,975 [salt.utils.extmods][INFO    ][24493] Copying '/var/cache/salt/minion/files/base/_grains/jenkins_plugins.py' to '/var/cache/salt/minion/extmods/grains/jenkins_plugins.py'
2017-10-29 08:49:33,975 [salt.utils.extmods][INFO    ][24493] Copying '/var/cache/salt/minion/files/base/_grains/keystone_policy.py' to '/var/cache/salt/minion/extmods/grains/keystone_policy.py'
2017-10-29 08:49:33,975 [salt.utils.extmods][INFO    ][24493] Copying '/var/cache/salt/minion/files/base/_grains/kubernetes.py' to '/var/cache/salt/minion/extmods/grains/kubernetes.py'
2017-10-29 08:49:33,975 [salt.utils.extmods][INFO    ][24493] Copying '/var/cache/salt/minion/files/base/_grains/neutron_policy.py' to '/var/cache/salt/minion/extmods/grains/neutron_policy.py'
2017-10-29 08:49:33,976 [salt.utils.extmods][INFO    ][24493] Copying '/var/cache/salt/minion/files/base/_grains/nova_policy.py' to '/var/cache/salt/minion/extmods/grains/nova_policy.py'
2017-10-29 08:49:33,976 [salt.utils.extmods][INFO    ][24493] Copying '/var/cache/salt/minion/files/base/_grains/ssh_fingerprints.py' to '/var/cache/salt/minion/extmods/grains/ssh_fingerprints.py'
2017-10-29 08:49:33,977 [salt.utils.extmods][INFO    ][24493] Creating module dir '/var/cache/salt/minion/extmods/renderers'
2017-10-29 08:49:33,980 [salt.utils.extmods][INFO    ][24493] Syncing renderers for environment 'base'
2017-10-29 08:49:33,980 [salt.utils.extmods][INFO    ][24493] Loading cache from salt://_renderers, for base)
2017-10-29 08:49:33,980 [salt.fileclient  ][INFO    ][24493] Caching directory '_renderers/' for environment 'base'
2017-10-29 08:49:34,004 [salt.utils.extmods][INFO    ][24493] Creating module dir '/var/cache/salt/minion/extmods/returners'
2017-10-29 08:49:34,006 [salt.utils.extmods][INFO    ][24493] Syncing returners for environment 'base'
2017-10-29 08:49:34,006 [salt.utils.extmods][INFO    ][24493] Loading cache from salt://_returners, for base)
2017-10-29 08:49:34,006 [salt.fileclient  ][INFO    ][24493] Caching directory '_returners/' for environment 'base'
2017-10-29 08:49:34,024 [salt.utils.extmods][INFO    ][24493] Creating module dir '/var/cache/salt/minion/extmods/output'
2017-10-29 08:49:34,026 [salt.utils.extmods][INFO    ][24493] Syncing output for environment 'base'
2017-10-29 08:49:34,027 [salt.utils.extmods][INFO    ][24493] Loading cache from salt://_output, for base)
2017-10-29 08:49:34,027 [salt.fileclient  ][INFO    ][24493] Caching directory '_output/' for environment 'base'
2017-10-29 08:49:34,043 [salt.utils.extmods][INFO    ][24493] Creating module dir '/var/cache/salt/minion/extmods/utils'
2017-10-29 08:49:34,046 [salt.utils.extmods][INFO    ][24493] Syncing utils for environment 'base'
2017-10-29 08:49:34,046 [salt.utils.extmods][INFO    ][24493] Loading cache from salt://_utils, for base)
2017-10-29 08:49:34,046 [salt.fileclient  ][INFO    ][24493] Caching directory '_utils/' for environment 'base'
2017-10-29 08:49:34,063 [salt.utils.extmods][INFO    ][24493] Creating module dir '/var/cache/salt/minion/extmods/log_handlers'
2017-10-29 08:49:34,066 [salt.utils.extmods][INFO    ][24493] Syncing log_handlers for environment 'base'
2017-10-29 08:49:34,066 [salt.utils.extmods][INFO    ][24493] Loading cache from salt://_log_handlers, for base)
2017-10-29 08:49:34,066 [salt.fileclient  ][INFO    ][24493] Caching directory '_log_handlers/' for environment 'base'
2017-10-29 08:49:34,087 [salt.utils.extmods][INFO    ][24493] Creating module dir '/var/cache/salt/minion/extmods/proxy'
2017-10-29 08:49:34,089 [salt.utils.extmods][INFO    ][24493] Syncing proxy for environment 'base'
2017-10-29 08:49:34,090 [salt.utils.extmods][INFO    ][24493] Loading cache from salt://_proxy, for base)
2017-10-29 08:49:34,090 [salt.fileclient  ][INFO    ][24493] Caching directory '_proxy/' for environment 'base'
2017-10-29 08:49:34,107 [salt.utils.extmods][INFO    ][24493] Creating module dir '/var/cache/salt/minion/extmods/engines'
2017-10-29 08:49:34,109 [salt.utils.extmods][INFO    ][24493] Syncing engines for environment 'base'
2017-10-29 08:49:34,109 [salt.utils.extmods][INFO    ][24493] Loading cache from salt://_engines, for base)
2017-10-29 08:49:34,109 [salt.fileclient  ][INFO    ][24493] Caching directory '_engines/' for environment 'base'
2017-10-29 08:49:34,134 [salt.minion      ][INFO    ][24493] Returning information for job: 20171029084928450181
2017-10-29 09:24:57,886 [salt.minion      ][INFO    ][24018] User sudo_ubuntu Executing command test.ping with jid 20171029092457863823
2017-10-29 09:24:57,906 [salt.minion      ][INFO    ][25247] Starting a new job with PID 25247
2017-10-29 09:24:57,936 [salt.minion      ][INFO    ][25247] Returning information for job: 20171029092457863823
2017-10-29 09:25:55,519 [salt.minion      ][INFO    ][24018] User sudo_ubuntu Executing command state.sls with jid 20171029092555502864
2017-10-29 09:25:55,531 [salt.minion      ][INFO    ][25272] Starting a new job with PID 25272
2017-10-29 09:25:57,056 [salt.state       ][INFO    ][25272] Loading fresh modules for state activity
2017-10-29 09:25:57,081 [salt.fileclient  ][INFO    ][25272] Fetching file from saltenv 'base', ** done ** 'keepalived/init.sls'
2017-10-29 09:25:57,099 [salt.fileclient  ][INFO    ][25272] Fetching file from saltenv 'base', ** done ** 'keepalived/cluster.sls'
2017-10-29 09:25:57,121 [salt.fileclient  ][INFO    ][25272] Fetching file from saltenv 'base', ** done ** 'keepalived/map.jinja'
2017-10-29 09:25:57,422 [salt.state       ][INFO    ][25272] Running state [lsof] at time 09:25:57.421650
2017-10-29 09:25:57,422 [salt.state       ][INFO    ][25272] Executing state pkg.installed for lsof
2017-10-29 09:25:57,422 [salt.loaded.int.module.cmdmod][INFO    ][25272] Executing command ['dpkg-query', '--showformat', '${Status} ${Package} ${Version} ${Architecture}\n', '-W'] in directory '/root'
2017-10-29 09:25:57,722 [salt.state       ][INFO    ][25272] Package lsof is already installed
2017-10-29 09:25:57,722 [salt.state       ][INFO    ][25272] Completed state [lsof] at time 09:25:57.722397 duration_in_ms=300.746
2017-10-29 09:25:57,723 [salt.state       ][INFO    ][25272] Running state [keepalived] at time 09:25:57.722614
2017-10-29 09:25:57,723 [salt.state       ][INFO    ][25272] Executing state pkg.installed for keepalived
2017-10-29 09:25:57,737 [salt.loaded.int.module.cmdmod][INFO    ][25272] Executing command ['apt-get', '-q', 'update'] in directory '/root'
2017-10-29 09:26:01,377 [salt.loaded.int.module.cmdmod][INFO    ][25272] 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-10-29 09:26:05,608 [salt.minion      ][INFO    ][24018] User sudo_ubuntu Executing command saltutil.find_job with jid 20171029092605591188
2017-10-29 09:26:05,622 [salt.minion      ][INFO    ][26245] Starting a new job with PID 26245
2017-10-29 09:26:05,633 [salt.minion      ][INFO    ][26245] Returning information for job: 20171029092605591188
2017-10-29 09:26:09,106 [salt.loaded.int.module.cmdmod][INFO    ][25272] Executing command ['dpkg-query', '--showformat', '${Status} ${Package} ${Version} ${Architecture}\n', '-W'] in directory '/root'
2017-10-29 09:26:09,129 [salt.state       ][INFO    ][25272] 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-10-29 09:26:09,137 [salt.state       ][INFO    ][25272] Loading fresh modules for state activity
2017-10-29 09:26:09,149 [salt.state       ][INFO    ][25272] Completed state [keepalived] at time 09:26:09.149043 duration_in_ms=11426.429
2017-10-29 09:26:09,151 [salt.state       ][INFO    ][25272] Running state [/etc/keepalived/keepalived.conf] at time 09:26:09.151098
2017-10-29 09:26:09,151 [salt.state       ][INFO    ][25272] Executing state file.managed for /etc/keepalived/keepalived.conf
2017-10-29 09:26:09,179 [salt.fileclient  ][INFO    ][25272] Fetching file from saltenv 'base', ** done ** 'keepalived/files/keepalived.conf'
2017-10-29 09:26:09,210 [salt.fileclient  ][INFO    ][25272] Fetching file from saltenv 'base', ** done ** 'keepalived/map.jinja'
2017-10-29 09:26:09,217 [salt.state       ][INFO    ][25272] File changed:
New file
2017-10-29 09:26:09,217 [salt.state       ][INFO    ][25272] Completed state [/etc/keepalived/keepalived.conf] at time 09:26:09.217433 duration_in_ms=66.335
2017-10-29 09:26:09,275 [salt.state       ][INFO    ][25272] Running state [keepalived] at time 09:26:09.274486
2017-10-29 09:26:09,275 [salt.state       ][INFO    ][25272] Executing state service.running for keepalived
2017-10-29 09:26:09,276 [salt.loaded.int.module.cmdmod][INFO    ][25272] Executing command ['systemctl', 'status', 'keepalived.service', '-n', '0'] in directory '/root'
2017-10-29 09:26:09,285 [salt.loaded.int.module.cmdmod][INFO    ][25272] Executing command ['systemctl', 'is-active', 'keepalived.service'] in directory '/root'
2017-10-29 09:26:09,292 [salt.loaded.int.module.cmdmod][INFO    ][25272] Executing command ['systemctl', 'is-enabled', 'keepalived.service'] in directory '/root'
2017-10-29 09:26:09,299 [salt.loaded.int.module.cmdmod][INFO    ][25272] Executing command ['systemctl', 'is-enabled', 'keepalived.service'] in directory '/root'
2017-10-29 09:26:09,307 [salt.loaded.int.module.cmdmod][INFO    ][25272] Executing command ['systemd-run', '--scope', 'systemctl', 'start', 'keepalived.service'] in directory '/root'
2017-10-29 09:26:09,364 [salt.loaded.int.module.cmdmod][INFO    ][25272] Executing command ['systemctl', 'is-active', 'keepalived.service'] in directory '/root'
2017-10-29 09:26:09,371 [salt.loaded.int.module.cmdmod][INFO    ][25272] Executing command ['systemctl', 'is-enabled', 'keepalived.service'] in directory '/root'
2017-10-29 09:26:09,379 [salt.loaded.int.module.cmdmod][INFO    ][25272] Executing command ['systemctl', 'is-enabled', 'keepalived.service'] in directory '/root'
2017-10-29 09:26:09,386 [salt.state       ][INFO    ][25272] {'keepalived': True}
2017-10-29 09:26:09,386 [salt.state       ][INFO    ][25272] Completed state [keepalived] at time 09:26:09.386011 duration_in_ms=111.525
2017-10-29 09:26:09,387 [salt.minion      ][INFO    ][25272] Returning information for job: 20171029092555502864
2017-10-29 09:29:02,697 [salt.minion      ][INFO    ][24018] User sudo_ubuntu Executing command pillar.get with jid 20171029092902683134
2017-10-29 09:29:02,716 [salt.minion      ][INFO    ][26920] Starting a new job with PID 26920
2017-10-29 09:29:02,722 [salt.minion      ][INFO    ][26920] Returning information for job: 20171029092902683134
2017-10-29 09:34:23,896 [salt.minion      ][INFO    ][24018] User sudo_ubuntu Executing command state.sls with jid 20171029093423882526
2017-10-29 09:34:23,912 [salt.minion      ][INFO    ][27027] Starting a new job with PID 27027
2017-10-29 09:34:25,310 [salt.state       ][INFO    ][27027] Loading fresh modules for state activity
2017-10-29 09:34:25,332 [salt.fileclient  ][INFO    ][27027] Fetching file from saltenv 'base', ** done ** 'glusterfs/server/service.sls'
2017-10-29 09:34:25,352 [salt.fileclient  ][INFO    ][27027] Fetching file from saltenv 'base', ** done ** 'glusterfs/map.jinja'
2017-10-29 09:34:25,612 [salt.state       ][INFO    ][27027] Running state [attr] at time 09:34:25.611929
2017-10-29 09:34:25,612 [salt.state       ][INFO    ][27027] Executing state pkg.installed for attr
2017-10-29 09:34:25,613 [salt.loaded.int.module.cmdmod][INFO    ][27027] Executing command ['dpkg-query', '--showformat', '${Status} ${Package} ${Version} ${Architecture}\n', '-W'] in directory '/root'
2017-10-29 09:34:25,869 [salt.loaded.int.module.cmdmod][INFO    ][27027] Executing command ['apt-get', '-q', 'update'] in directory '/root'
2017-10-29 09:34:27,339 [salt.loaded.int.module.cmdmod][INFO    ][27027] 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-10-29 09:34:29,715 [salt.loaded.int.module.cmdmod][INFO    ][27027] Executing command ['dpkg-query', '--showformat', '${Status} ${Package} ${Version} ${Architecture}\n', '-W'] in directory '/root'
2017-10-29 09:34:29,739 [salt.state       ][INFO    ][27027] Made the following changes:
'attr' changed from 'absent' to '1:2.4.47-2'

2017-10-29 09:34:29,748 [salt.state       ][INFO    ][27027] Loading fresh modules for state activity
2017-10-29 09:34:29,760 [salt.state       ][INFO    ][27027] Completed state [attr] at time 09:34:29.760018 duration_in_ms=4148.089
2017-10-29 09:34:29,766 [salt.state       ][INFO    ][27027] Running state [glusterfs-server] at time 09:34:29.765743
2017-10-29 09:34:29,766 [salt.state       ][INFO    ][27027] Executing state pkg.installed for glusterfs-server
2017-10-29 09:34:29,951 [salt.loaded.int.module.cmdmod][INFO    ][27027] 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-10-29 09:34:34,026 [salt.minion      ][INFO    ][24018] User sudo_ubuntu Executing command saltutil.find_job with jid 20171029093433972934
2017-10-29 09:34:34,040 [salt.minion      ][INFO    ][28059] Starting a new job with PID 28059
2017-10-29 09:34:34,055 [salt.minion      ][INFO    ][28059] Returning information for job: 20171029093433972934
2017-10-29 09:34:44,235 [salt.minion      ][INFO    ][24018] User sudo_ubuntu Executing command saltutil.find_job with jid 20171029093444203621
2017-10-29 09:34:44,249 [salt.minion      ][INFO    ][30898] Starting a new job with PID 30898
2017-10-29 09:34:44,259 [salt.minion      ][INFO    ][30898] Returning information for job: 20171029093444203621
2017-10-29 09:34:48,266 [salt.loaded.int.module.cmdmod][INFO    ][27027] Executing command ['dpkg-query', '--showformat', '${Status} ${Package} ${Version} ${Architecture}\n', '-W'] in directory '/root'
2017-10-29 09:34:48,291 [salt.state       ][INFO    ][27027] 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-10-29 09:34:48,299 [salt.state       ][INFO    ][27027] Loading fresh modules for state activity
2017-10-29 09:34:48,311 [salt.state       ][INFO    ][27027] Completed state [glusterfs-server] at time 09:34:48.311412 duration_in_ms=18545.668
2017-10-29 09:34:48,316 [salt.state       ][INFO    ][27027] Running state [bc] at time 09:34:48.316337
2017-10-29 09:34:48,317 [salt.state       ][INFO    ][27027] Executing state pkg.installed for bc
2017-10-29 09:34:48,578 [salt.loaded.int.module.cmdmod][INFO    ][27027] 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-10-29 09:34:51,343 [salt.loaded.int.module.cmdmod][INFO    ][27027] Executing command ['dpkg-query', '--showformat', '${Status} ${Package} ${Version} ${Architecture}\n', '-W'] in directory '/root'
2017-10-29 09:34:51,370 [salt.state       ][INFO    ][27027] Made the following changes:
'bc' changed from 'absent' to '1.06.95-9build1'

2017-10-29 09:34:51,378 [salt.state       ][INFO    ][27027] Loading fresh modules for state activity
2017-10-29 09:34:51,391 [salt.state       ][INFO    ][27027] Completed state [bc] at time 09:34:51.391374 duration_in_ms=3075.037
2017-10-29 09:34:51,455 [salt.state       ][INFO    ][27027] Running state [glusterfs-server] at time 09:34:51.454996
2017-10-29 09:34:51,455 [salt.state       ][INFO    ][27027] Executing state service.running for glusterfs-server
2017-10-29 09:34:51,457 [salt.loaded.int.module.cmdmod][INFO    ][27027] Executing command ['systemctl', 'status', 'glusterfs-server.service', '-n', '0'] in directory '/root'
2017-10-29 09:34:51,467 [salt.loaded.int.module.cmdmod][INFO    ][27027] Executing command ['systemctl', 'is-active', 'glusterfs-server.service'] in directory '/root'
2017-10-29 09:34:51,475 [salt.loaded.int.module.cmdmod][INFO    ][27027] Executing command ['systemctl', 'is-enabled', 'glusterfs-server.service'] in directory '/root'
2017-10-29 09:34:51,483 [salt.state       ][INFO    ][27027] The service glusterfs-server is already running
2017-10-29 09:34:51,484 [salt.state       ][INFO    ][27027] Completed state [glusterfs-server] at time 09:34:51.483637 duration_in_ms=28.641
2017-10-29 09:34:51,486 [salt.state       ][INFO    ][27027] Running state [/etc/systemd/system/glusterfs-server.service.d/override.conf] at time 09:34:51.485536
2017-10-29 09:34:51,486 [salt.state       ][INFO    ][27027] Executing state file.managed for /etc/systemd/system/glusterfs-server.service.d/override.conf
2017-10-29 09:34:51,498 [salt.state       ][INFO    ][27027] File changed:
New file
2017-10-29 09:34:51,498 [salt.state       ][INFO    ][27027] Completed state [/etc/systemd/system/glusterfs-server.service.d/override.conf] at time 09:34:51.497723 duration_in_ms=12.186
2017-10-29 09:34:51,498 [salt.state       ][INFO    ][27027] Running state [/srv/glusterfs/glance] at time 09:34:51.497883
2017-10-29 09:34:51,498 [salt.state       ][INFO    ][27027] Executing state file.directory for /srv/glusterfs/glance
2017-10-29 09:34:51,499 [salt.state       ][INFO    ][27027] {'/srv/glusterfs/glance': 'New Dir'}
2017-10-29 09:34:51,499 [salt.state       ][INFO    ][27027] Completed state [/srv/glusterfs/glance] at time 09:34:51.498754 duration_in_ms=0.87
2017-10-29 09:34:51,499 [salt.state       ][INFO    ][27027] Running state [/srv/glusterfs/keystone-keys] at time 09:34:51.498899
2017-10-29 09:34:51,499 [salt.state       ][INFO    ][27027] Executing state file.directory for /srv/glusterfs/keystone-keys
2017-10-29 09:34:51,499 [salt.state       ][INFO    ][27027] {'/srv/glusterfs/keystone-keys': 'New Dir'}
2017-10-29 09:34:51,500 [salt.state       ][INFO    ][27027] Completed state [/srv/glusterfs/keystone-keys] at time 09:34:51.499522 duration_in_ms=0.624
2017-10-29 09:34:51,500 [salt.state       ][INFO    ][27027] Running state [/srv/glusterfs/nova_instances] at time 09:34:51.499665
2017-10-29 09:34:51,500 [salt.state       ][INFO    ][27027] Executing state file.directory for /srv/glusterfs/nova_instances
2017-10-29 09:34:51,500 [salt.state       ][INFO    ][27027] {'/srv/glusterfs/nova_instances': 'New Dir'}
2017-10-29 09:34:51,500 [salt.state       ][INFO    ][27027] Completed state [/srv/glusterfs/nova_instances] at time 09:34:51.500314 duration_in_ms=0.649
2017-10-29 09:34:51,500 [salt.state       ][INFO    ][27027] Running state [/srv/glusterfs/keystone-credential-keys] at time 09:34:51.500456
2017-10-29 09:34:51,501 [salt.state       ][INFO    ][27027] Executing state file.directory for /srv/glusterfs/keystone-credential-keys
2017-10-29 09:34:51,501 [salt.state       ][INFO    ][27027] {'/srv/glusterfs/keystone-credential-keys': 'New Dir'}
2017-10-29 09:34:51,501 [salt.state       ][INFO    ][27027] Completed state [/srv/glusterfs/keystone-credential-keys] at time 09:34:51.501066 duration_in_ms=0.611
2017-10-29 09:34:51,502 [salt.minion      ][INFO    ][27027] Returning information for job: 20171029093423882526
2017-10-29 09:34:54,239 [salt.minion      ][INFO    ][24018] User sudo_ubuntu Executing command test.ping with jid 20171029093454224810
2017-10-29 09:34:54,253 [salt.minion      ][INFO    ][31777] Starting a new job with PID 31777
2017-10-29 09:34:54,280 [salt.minion      ][INFO    ][31777] Returning information for job: 20171029093454224810
2017-10-29 09:35:40,439 [salt.minion      ][INFO    ][24018] User sudo_ubuntu Executing command state.sls with jid 20171029093540423764
2017-10-29 09:35:40,455 [salt.minion      ][INFO    ][32009] Starting a new job with PID 32009
2017-10-29 09:35:40,890 [salt.state       ][INFO    ][32009] Loading fresh modules for state activity
2017-10-29 09:35:40,913 [salt.fileclient  ][INFO    ][32009] Fetching file from saltenv 'base', ** done ** 'glusterfs/server/setup.sls'
2017-10-29 09:35:40,945 [salt.fileclient  ][INFO    ][32009] Fetching file from saltenv 'base', ** done ** 'glusterfs/map.jinja'
2017-10-29 09:35:41,008 [salt.fileclient  ][INFO    ][32009] Fetching file from saltenv 'base', ** done ** 'glusterfs/server/service.sls'
2017-10-29 09:35:41,026 [salt.fileclient  ][INFO    ][32009] Fetching file from saltenv 'base', ** done ** 'glusterfs/map.jinja'
2017-10-29 09:35:41,295 [salt.state       ][INFO    ][32009] Running state [attr] at time 09:35:41.295330
2017-10-29 09:35:41,296 [salt.state       ][INFO    ][32009] Executing state pkg.installed for attr
2017-10-29 09:35:41,296 [salt.loaded.int.module.cmdmod][INFO    ][32009] Executing command ['dpkg-query', '--showformat', '${Status} ${Package} ${Version} ${Architecture}\n', '-W'] in directory '/root'
2017-10-29 09:35:41,544 [salt.state       ][INFO    ][32009] Package attr is already installed
2017-10-29 09:35:41,544 [salt.state       ][INFO    ][32009] Completed state [attr] at time 09:35:41.543999 duration_in_ms=248.67
2017-10-29 09:35:41,544 [salt.state       ][INFO    ][32009] Running state [glusterfs-server] at time 09:35:41.544219
2017-10-29 09:35:41,544 [salt.state       ][INFO    ][32009] Executing state pkg.installed for glusterfs-server
2017-10-29 09:35:41,547 [salt.state       ][INFO    ][32009] Package glusterfs-server is already installed
2017-10-29 09:35:41,547 [salt.state       ][INFO    ][32009] Completed state [glusterfs-server] at time 09:35:41.547151 duration_in_ms=2.932
2017-10-29 09:35:41,547 [salt.state       ][INFO    ][32009] Running state [bc] at time 09:35:41.547321
2017-10-29 09:35:41,547 [salt.state       ][INFO    ][32009] Executing state pkg.installed for bc
2017-10-29 09:35:41,550 [salt.state       ][INFO    ][32009] Package bc is already installed
2017-10-29 09:35:41,550 [salt.state       ][INFO    ][32009] Completed state [bc] at time 09:35:41.550162 duration_in_ms=2.841
2017-10-29 09:35:41,551 [salt.state       ][INFO    ][32009] Running state [glusterfs-server] at time 09:35:41.550998
2017-10-29 09:35:41,551 [salt.state       ][INFO    ][32009] Executing state service.running for glusterfs-server
2017-10-29 09:35:41,552 [salt.loaded.int.module.cmdmod][INFO    ][32009] Executing command ['systemctl', 'status', 'glusterfs-server.service', '-n', '0'] in directory '/root'
2017-10-29 09:35:41,561 [salt.loaded.int.module.cmdmod][INFO    ][32009] Executing command ['systemctl', '--system', 'daemon-reload'] in directory '/root'
2017-10-29 09:35:41,604 [salt.loaded.int.module.cmdmod][INFO    ][32009] Executing command ['systemctl', 'status', 'glusterfs-server.service', '-n', '0'] in directory '/root'
2017-10-29 09:35:41,618 [salt.loaded.int.module.cmdmod][INFO    ][32009] Executing command ['systemctl', 'is-active', 'glusterfs-server.service'] in directory '/root'
2017-10-29 09:35:41,625 [salt.loaded.int.module.cmdmod][INFO    ][32009] Executing command ['systemctl', 'is-enabled', 'glusterfs-server.service'] in directory '/root'
2017-10-29 09:35:41,633 [salt.state       ][INFO    ][32009] The service glusterfs-server is already running
2017-10-29 09:35:41,634 [salt.state       ][INFO    ][32009] Completed state [glusterfs-server] at time 09:35:41.633508 duration_in_ms=82.51
2017-10-29 09:35:41,635 [salt.state       ][INFO    ][32009] Running state [/etc/systemd/system/glusterfs-server.service.d/override.conf] at time 09:35:41.634950
2017-10-29 09:35:41,635 [salt.state       ][INFO    ][32009] Executing state file.managed for /etc/systemd/system/glusterfs-server.service.d/override.conf
2017-10-29 09:35:41,645 [salt.state       ][INFO    ][32009] File /etc/systemd/system/glusterfs-server.service.d/override.conf is in the correct state
2017-10-29 09:35:41,645 [salt.state       ][INFO    ][32009] Completed state [/etc/systemd/system/glusterfs-server.service.d/override.conf] at time 09:35:41.645385 duration_in_ms=10.435
2017-10-29 09:35:41,646 [salt.state       ][INFO    ][32009] Running state [/srv/glusterfs/glance] at time 09:35:41.645543
2017-10-29 09:35:41,646 [salt.state       ][INFO    ][32009] Executing state file.directory for /srv/glusterfs/glance
2017-10-29 09:35:41,646 [salt.state       ][INFO    ][32009] Directory /srv/glusterfs/glance is in the correct state
2017-10-29 09:35:41,646 [salt.state       ][INFO    ][32009] Completed state [/srv/glusterfs/glance] at time 09:35:41.646135 duration_in_ms=0.593
2017-10-29 09:35:41,646 [salt.state       ][INFO    ][32009] Running state [/srv/glusterfs/keystone-keys] at time 09:35:41.646279
2017-10-29 09:35:41,646 [salt.state       ][INFO    ][32009] Executing state file.directory for /srv/glusterfs/keystone-keys
2017-10-29 09:35:41,647 [salt.state       ][INFO    ][32009] Directory /srv/glusterfs/keystone-keys is in the correct state
2017-10-29 09:35:41,647 [salt.state       ][INFO    ][32009] Completed state [/srv/glusterfs/keystone-keys] at time 09:35:41.646840 duration_in_ms=0.561
2017-10-29 09:35:41,647 [salt.state       ][INFO    ][32009] Running state [/srv/glusterfs/nova_instances] at time 09:35:41.646983
2017-10-29 09:35:41,647 [salt.state       ][INFO    ][32009] Executing state file.directory for /srv/glusterfs/nova_instances
2017-10-29 09:35:41,647 [salt.state       ][INFO    ][32009] Directory /srv/glusterfs/nova_instances is in the correct state
2017-10-29 09:35:41,648 [salt.state       ][INFO    ][32009] Completed state [/srv/glusterfs/nova_instances] at time 09:35:41.647573 duration_in_ms=0.59
2017-10-29 09:35:41,648 [salt.state       ][INFO    ][32009] Running state [/srv/glusterfs/keystone-credential-keys] at time 09:35:41.647716
2017-10-29 09:35:41,648 [salt.state       ][INFO    ][32009] Executing state file.directory for /srv/glusterfs/keystone-credential-keys
2017-10-29 09:35:41,648 [salt.state       ][INFO    ][32009] Directory /srv/glusterfs/keystone-credential-keys is in the correct state
2017-10-29 09:35:41,648 [salt.state       ][INFO    ][32009] Completed state [/srv/glusterfs/keystone-credential-keys] at time 09:35:41.648331 duration_in_ms=0.614
2017-10-29 09:35:41,699 [salt.loaded.int.module.cmdmod][INFO    ][32009] Executing command ['git', '--version'] in directory '/root'
2017-10-29 09:35:41,787 [salt.state       ][INFO    ][32009] Running state [sleep 5] at time 09:35:41.787347
2017-10-29 09:35:41,788 [salt.state       ][INFO    ][32009] Executing state cmd.wait for sleep 5
2017-10-29 09:35:41,788 [salt.state       ][INFO    ][32009] No changes made for sleep 5
2017-10-29 09:35:41,788 [salt.state       ][INFO    ][32009] Completed state [sleep 5] at time 09:35:41.787927 duration_in_ms=0.58
2017-10-29 09:35:41,788 [salt.state       ][INFO    ][32009] Running state [10.167.4.141] at time 09:35:41.788314
2017-10-29 09:35:41,788 [salt.state       ][INFO    ][32009] Executing state glusterfs.peered for 10.167.4.141
2017-10-29 09:35:41,789 [salt.loaded.int.module.cmdmod][INFO    ][32009] Executing command 'gluster --version' in directory '/root'
2017-10-29 09:35:41,798 [salt.loaded.int.module.cmdmod][INFO    ][32009] Executing command 'gluster --xml --mode=script' in directory '/root'
2017-10-29 09:35:41,850 [salt.loaded.int.module.cmdmod][INFO    ][32009] Executing command 'gluster --version' in directory '/root'
2017-10-29 09:35:41,858 [salt.loaded.int.module.cmdmod][INFO    ][32009] Executing command 'gluster --xml --mode=script' in directory '/root'
2017-10-29 09:35:41,908 [salt.loaded.int.module.cmdmod][INFO    ][32009] Executing command 'gluster --version' in directory '/root'
2017-10-29 09:35:41,916 [salt.loaded.int.module.cmdmod][INFO    ][32009] Executing command 'gluster --xml --mode=script' in directory '/root'
2017-10-29 09:35:41,965 [salt.loaded.int.module.cmdmod][INFO    ][32009] Executing command 'gluster --version' in directory '/root'
2017-10-29 09:35:41,973 [salt.loaded.int.module.cmdmod][INFO    ][32009] Executing command 'gluster --xml --mode=script' in directory '/root'
2017-10-29 09:35:42,021 [salt.state       ][INFO    ][32009] Peering with localhost is not needed
2017-10-29 09:35:42,021 [salt.state       ][INFO    ][32009] Completed state [10.167.4.141] at time 09:35:42.020835 duration_in_ms=232.521
2017-10-29 09:35:42,023 [salt.state       ][INFO    ][32009] Running state [10.167.4.142] at time 09:35:42.022995
2017-10-29 09:35:42,023 [salt.state       ][INFO    ][32009] Executing state glusterfs.peered for 10.167.4.142
2017-10-29 09:35:42,024 [salt.loaded.int.module.cmdmod][INFO    ][32009] Executing command 'gluster --version' in directory '/root'
2017-10-29 09:35:42,032 [salt.loaded.int.module.cmdmod][INFO    ][32009] Executing command 'gluster --xml --mode=script' in directory '/root'
2017-10-29 09:35:42,078 [salt.state       ][INFO    ][32009] Host 10.167.4.142 already peered
2017-10-29 09:35:42,079 [salt.state       ][INFO    ][32009] Completed state [10.167.4.142] at time 09:35:42.078688 duration_in_ms=55.693
2017-10-29 09:35:42,081 [salt.state       ][INFO    ][32009] Running state [10.167.4.143] at time 09:35:42.081064
2017-10-29 09:35:42,081 [salt.state       ][INFO    ][32009] Executing state glusterfs.peered for 10.167.4.143
2017-10-29 09:35:42,082 [salt.loaded.int.module.cmdmod][INFO    ][32009] Executing command 'gluster --version' in directory '/root'
2017-10-29 09:35:42,090 [salt.loaded.int.module.cmdmod][INFO    ][32009] Executing command 'gluster --xml --mode=script' in directory '/root'
2017-10-29 09:35:42,137 [salt.state       ][INFO    ][32009] Host 10.167.4.143 already peered
2017-10-29 09:35:42,137 [salt.state       ][INFO    ][32009] Completed state [10.167.4.143] at time 09:35:42.137452 duration_in_ms=56.387
2017-10-29 09:35:42,138 [salt.state       ][INFO    ][32009] Running state [glance] at time 09:35:42.138289
2017-10-29 09:35:42,139 [salt.state       ][INFO    ][32009] Executing state glusterfs.created for glance
2017-10-29 09:35:42,139 [salt.loaded.int.module.cmdmod][INFO    ][32009] Executing command 'gluster --version' in directory '/root'
2017-10-29 09:35:42,148 [salt.loaded.int.module.cmdmod][INFO    ][32009] Executing command 'gluster --xml --mode=script' in directory '/root'
2017-10-29 09:35:42,196 [salt.loaded.int.module.cmdmod][INFO    ][32009] Executing command 'gluster --version' in directory '/root'
2017-10-29 09:35:42,205 [salt.loaded.int.module.cmdmod][INFO    ][32009] Executing command 'gluster --xml --mode=script' in directory '/root'
2017-10-29 09:35:42,257 [salt.state       ][INFO    ][32009] Volume glance already exists and is started.
2017-10-29 09:35:42,257 [salt.state       ][INFO    ][32009] Completed state [glance] at time 09:35:42.257318 duration_in_ms=119.029
2017-10-29 09:35:42,260 [salt.state       ][INFO    ][32009] Running state [gluster volume set 'glance' 'diagnostics.brick-log-level' 'WARNING'] at time 09:35:42.260087
2017-10-29 09:35:42,260 [salt.state       ][INFO    ][32009] Executing state cmd.run for gluster volume set 'glance' 'diagnostics.brick-log-level' 'WARNING'
2017-10-29 09:35:42,261 [salt.loaded.int.module.cmdmod][INFO    ][32009] Executing command 'gluster volume info 'glance' | grep 'diagnostics.brick-log-level: WARNING'' in directory '/root'
2017-10-29 09:35:42,308 [salt.state       ][INFO    ][32009] unless execution succeeded
2017-10-29 09:35:42,308 [salt.state       ][INFO    ][32009] Completed state [gluster volume set 'glance' 'diagnostics.brick-log-level' 'WARNING'] at time 09:35:42.308128 duration_in_ms=48.039
2017-10-29 09:35:42,309 [salt.state       ][INFO    ][32009] Running state [gluster volume set 'glance' 'network.remote-dio' 'True'] at time 09:35:42.308723
2017-10-29 09:35:42,309 [salt.state       ][INFO    ][32009] Executing state cmd.run for gluster volume set 'glance' 'network.remote-dio' 'True'
2017-10-29 09:35:42,310 [salt.loaded.int.module.cmdmod][INFO    ][32009] Executing command 'gluster volume info 'glance' | grep 'network.remote-dio: True'' in directory '/root'
2017-10-29 09:35:42,361 [salt.state       ][INFO    ][32009] unless execution succeeded
2017-10-29 09:35:42,361 [salt.state       ][INFO    ][32009] Completed state [gluster volume set 'glance' 'network.remote-dio' 'True'] at time 09:35:42.361120 duration_in_ms=52.397
2017-10-29 09:35:42,362 [salt.state       ][INFO    ][32009] Running state [gluster volume set 'glance' 'nfs.disable' 'True'] at time 09:35:42.361539
2017-10-29 09:35:42,362 [salt.state       ][INFO    ][32009] Executing state cmd.run for gluster volume set 'glance' 'nfs.disable' 'True'
2017-10-29 09:35:42,362 [salt.loaded.int.module.cmdmod][INFO    ][32009] Executing command 'gluster volume info 'glance' | grep 'nfs.disable: True'' in directory '/root'
2017-10-29 09:35:42,409 [salt.state       ][INFO    ][32009] unless execution succeeded
2017-10-29 09:35:42,409 [salt.state       ][INFO    ][32009] Completed state [gluster volume set 'glance' 'nfs.disable' 'True'] at time 09:35:42.409324 duration_in_ms=47.785
2017-10-29 09:35:42,410 [salt.state       ][INFO    ][32009] Running state [gluster volume set 'glance' 'diagnostics.client-log-level' 'WARNING'] at time 09:35:42.409766
2017-10-29 09:35:42,410 [salt.state       ][INFO    ][32009] Executing state cmd.run for gluster volume set 'glance' 'diagnostics.client-log-level' 'WARNING'
2017-10-29 09:35:42,410 [salt.loaded.int.module.cmdmod][INFO    ][32009] Executing command 'gluster volume info 'glance' | grep 'diagnostics.client-log-level: WARNING'' in directory '/root'
2017-10-29 09:35:42,458 [salt.state       ][INFO    ][32009] unless execution succeeded
2017-10-29 09:35:42,458 [salt.state       ][INFO    ][32009] Completed state [gluster volume set 'glance' 'diagnostics.client-log-level' 'WARNING'] at time 09:35:42.458187 duration_in_ms=48.42
2017-10-29 09:35:42,459 [salt.state       ][INFO    ][32009] Running state [gluster volume set 'glance' 'cluster.readdir-optimize' 'True'] at time 09:35:42.458668
2017-10-29 09:35:42,459 [salt.state       ][INFO    ][32009] Executing state cmd.run for gluster volume set 'glance' 'cluster.readdir-optimize' 'True'
2017-10-29 09:35:42,459 [salt.loaded.int.module.cmdmod][INFO    ][32009] Executing command 'gluster volume info 'glance' | grep 'cluster.readdir-optimize: True'' in directory '/root'
2017-10-29 09:35:42,507 [salt.state       ][INFO    ][32009] unless execution succeeded
2017-10-29 09:35:42,507 [salt.state       ][INFO    ][32009] Completed state [gluster volume set 'glance' 'cluster.readdir-optimize' 'True'] at time 09:35:42.507131 duration_in_ms=48.462
2017-10-29 09:35:42,508 [salt.state       ][INFO    ][32009] Running state [glance] at time 09:35:42.508158
2017-10-29 09:35:42,508 [salt.state       ][INFO    ][32009] Executing state glusterfs.started for glance
2017-10-29 09:35:42,509 [salt.loaded.int.module.cmdmod][INFO    ][32009] Executing command 'gluster --version' in directory '/root'
2017-10-29 09:35:42,517 [salt.loaded.int.module.cmdmod][INFO    ][32009] Executing command 'gluster --xml --mode=script' in directory '/root'
2017-10-29 09:35:42,564 [salt.loaded.int.module.cmdmod][INFO    ][32009] Executing command 'gluster --version' in directory '/root'
2017-10-29 09:35:42,574 [salt.loaded.int.module.cmdmod][INFO    ][32009] Executing command 'gluster --xml --mode=script' in directory '/root'
2017-10-29 09:35:42,626 [salt.state       ][INFO    ][32009] Volume glance is already started
2017-10-29 09:35:42,626 [salt.state       ][INFO    ][32009] Completed state [glance] at time 09:35:42.626333 duration_in_ms=118.174
2017-10-29 09:35:42,627 [salt.state       ][INFO    ][32009] Running state [keystone-keys] at time 09:35:42.627098
2017-10-29 09:35:42,627 [salt.state       ][INFO    ][32009] Executing state glusterfs.created for keystone-keys
2017-10-29 09:35:42,628 [salt.loaded.int.module.cmdmod][INFO    ][32009] Executing command 'gluster --version' in directory '/root'
2017-10-29 09:35:42,637 [salt.loaded.int.module.cmdmod][INFO    ][32009] Executing command 'gluster --xml --mode=script' in directory '/root'
2017-10-29 09:35:42,685 [salt.loaded.int.module.cmdmod][INFO    ][32009] Executing command 'gluster --version' in directory '/root'
2017-10-29 09:35:42,694 [salt.loaded.int.module.cmdmod][INFO    ][32009] Executing command 'gluster --xml --mode=script' in directory '/root'
2017-10-29 09:35:42,744 [salt.state       ][INFO    ][32009] Volume keystone-keys already exists and is started.
2017-10-29 09:35:42,745 [salt.state       ][INFO    ][32009] Completed state [keystone-keys] at time 09:35:42.744684 duration_in_ms=117.586
2017-10-29 09:35:42,748 [salt.state       ][INFO    ][32009] Running state [gluster volume set 'keystone-keys' 'network.remote-dio' 'True'] at time 09:35:42.747494
2017-10-29 09:35:42,748 [salt.state       ][INFO    ][32009] Executing state cmd.run for gluster volume set 'keystone-keys' 'network.remote-dio' 'True'
2017-10-29 09:35:42,748 [salt.loaded.int.module.cmdmod][INFO    ][32009] Executing command 'gluster volume info 'keystone-keys' | grep 'network.remote-dio: True'' in directory '/root'
2017-10-29 09:35:42,796 [salt.state       ][INFO    ][32009] unless execution succeeded
2017-10-29 09:35:42,796 [salt.state       ][INFO    ][32009] Completed state [gluster volume set 'keystone-keys' 'network.remote-dio' 'True'] at time 09:35:42.796382 duration_in_ms=48.887
2017-10-29 09:35:42,797 [salt.state       ][INFO    ][32009] Running state [gluster volume set 'keystone-keys' 'diagnostics.brick-log-level' 'WARNING'] at time 09:35:42.796873
2017-10-29 09:35:42,797 [salt.state       ][INFO    ][32009] Executing state cmd.run for gluster volume set 'keystone-keys' 'diagnostics.brick-log-level' 'WARNING'
2017-10-29 09:35:42,798 [salt.loaded.int.module.cmdmod][INFO    ][32009] Executing command 'gluster volume info 'keystone-keys' | grep 'diagnostics.brick-log-level: WARNING'' in directory '/root'
2017-10-29 09:35:42,848 [salt.state       ][INFO    ][32009] unless execution succeeded
2017-10-29 09:35:42,848 [salt.state       ][INFO    ][32009] Completed state [gluster volume set 'keystone-keys' 'diagnostics.brick-log-level' 'WARNING'] at time 09:35:42.848258 duration_in_ms=51.385
2017-10-29 09:35:42,849 [salt.state       ][INFO    ][32009] Running state [gluster volume set 'keystone-keys' 'diagnostics.client-log-level' 'WARNING'] at time 09:35:42.848663
2017-10-29 09:35:42,849 [salt.state       ][INFO    ][32009] Executing state cmd.run for gluster volume set 'keystone-keys' 'diagnostics.client-log-level' 'WARNING'
2017-10-29 09:35:42,849 [salt.loaded.int.module.cmdmod][INFO    ][32009] Executing command 'gluster volume info 'keystone-keys' | grep 'diagnostics.client-log-level: WARNING'' in directory '/root'
2017-10-29 09:35:42,897 [salt.state       ][INFO    ][32009] unless execution succeeded
2017-10-29 09:35:42,897 [salt.state       ][INFO    ][32009] Completed state [gluster volume set 'keystone-keys' 'diagnostics.client-log-level' 'WARNING'] at time 09:35:42.897203 duration_in_ms=48.539
2017-10-29 09:35:42,898 [salt.state       ][INFO    ][32009] Running state [gluster volume set 'keystone-keys' 'nfs.disable' 'True'] at time 09:35:42.897687
2017-10-29 09:35:42,898 [salt.state       ][INFO    ][32009] Executing state cmd.run for gluster volume set 'keystone-keys' 'nfs.disable' 'True'
2017-10-29 09:35:42,898 [salt.loaded.int.module.cmdmod][INFO    ][32009] Executing command 'gluster volume info 'keystone-keys' | grep 'nfs.disable: True'' in directory '/root'
2017-10-29 09:35:42,949 [salt.state       ][INFO    ][32009] unless execution succeeded
2017-10-29 09:35:42,949 [salt.state       ][INFO    ][32009] Completed state [gluster volume set 'keystone-keys' 'nfs.disable' 'True'] at time 09:35:42.948970 duration_in_ms=51.282
2017-10-29 09:35:42,949 [salt.state       ][INFO    ][32009] Running state [gluster volume set 'keystone-keys' 'cluster.readdir-optimize' 'True'] at time 09:35:42.949375
2017-10-29 09:35:42,950 [salt.state       ][INFO    ][32009] Executing state cmd.run for gluster volume set 'keystone-keys' 'cluster.readdir-optimize' 'True'
2017-10-29 09:35:42,950 [salt.loaded.int.module.cmdmod][INFO    ][32009] Executing command 'gluster volume info 'keystone-keys' | grep 'cluster.readdir-optimize: True'' in directory '/root'
2017-10-29 09:35:42,997 [salt.state       ][INFO    ][32009] unless execution succeeded
2017-10-29 09:35:42,997 [salt.state       ][INFO    ][32009] Completed state [gluster volume set 'keystone-keys' 'cluster.readdir-optimize' 'True'] at time 09:35:42.997151 duration_in_ms=47.775
2017-10-29 09:35:42,998 [salt.state       ][INFO    ][32009] Running state [keystone-keys] at time 09:35:42.998051
2017-10-29 09:35:42,998 [salt.state       ][INFO    ][32009] Executing state glusterfs.started for keystone-keys
2017-10-29 09:35:42,999 [salt.loaded.int.module.cmdmod][INFO    ][32009] Executing command 'gluster --version' in directory '/root'
2017-10-29 09:35:43,007 [salt.loaded.int.module.cmdmod][INFO    ][32009] Executing command 'gluster --xml --mode=script' in directory '/root'
2017-10-29 09:35:43,054 [salt.loaded.int.module.cmdmod][INFO    ][32009] Executing command 'gluster --version' in directory '/root'
2017-10-29 09:35:43,063 [salt.loaded.int.module.cmdmod][INFO    ][32009] Executing command 'gluster --xml --mode=script' in directory '/root'
2017-10-29 09:35:43,115 [salt.state       ][INFO    ][32009] Volume keystone-keys is already started
2017-10-29 09:35:43,115 [salt.state       ][INFO    ][32009] Completed state [keystone-keys] at time 09:35:43.115097 duration_in_ms=117.045
2017-10-29 09:35:43,116 [salt.state       ][INFO    ][32009] Running state [nova_instances] at time 09:35:43.116167
2017-10-29 09:35:43,116 [salt.state       ][INFO    ][32009] Executing state glusterfs.created for nova_instances
2017-10-29 09:35:43,117 [salt.loaded.int.module.cmdmod][INFO    ][32009] Executing command 'gluster --version' in directory '/root'
2017-10-29 09:35:43,125 [salt.loaded.int.module.cmdmod][INFO    ][32009] Executing command 'gluster --xml --mode=script' in directory '/root'
2017-10-29 09:35:43,173 [salt.loaded.int.module.cmdmod][INFO    ][32009] Executing command 'gluster --version' in directory '/root'
2017-10-29 09:35:43,182 [salt.loaded.int.module.cmdmod][INFO    ][32009] Executing command 'gluster --xml --mode=script' in directory '/root'
2017-10-29 09:35:43,236 [salt.state       ][INFO    ][32009] Volume nova_instances already exists and is started.
2017-10-29 09:35:43,237 [salt.state       ][INFO    ][32009] Completed state [nova_instances] at time 09:35:43.236576 duration_in_ms=120.408
2017-10-29 09:35:43,239 [salt.state       ][INFO    ][32009] Running state [gluster volume set 'nova_instances' 'diagnostics.brick-log-level' 'WARNING'] at time 09:35:43.239246
2017-10-29 09:35:43,239 [salt.state       ][INFO    ][32009] Executing state cmd.run for gluster volume set 'nova_instances' 'diagnostics.brick-log-level' 'WARNING'
2017-10-29 09:35:43,240 [salt.loaded.int.module.cmdmod][INFO    ][32009] Executing command 'gluster volume info 'nova_instances' | grep 'diagnostics.brick-log-level: WARNING'' in directory '/root'
2017-10-29 09:35:43,287 [salt.state       ][INFO    ][32009] unless execution succeeded
2017-10-29 09:35:43,287 [salt.state       ][INFO    ][32009] Completed state [gluster volume set 'nova_instances' 'diagnostics.brick-log-level' 'WARNING'] at time 09:35:43.287278 duration_in_ms=48.031
2017-10-29 09:35:43,288 [salt.state       ][INFO    ][32009] Running state [gluster volume set 'nova_instances' 'cluster.readdir-optimize' 'On'] at time 09:35:43.287788
2017-10-29 09:35:43,288 [salt.state       ][INFO    ][32009] Executing state cmd.run for gluster volume set 'nova_instances' 'cluster.readdir-optimize' 'On'
2017-10-29 09:35:43,289 [salt.loaded.int.module.cmdmod][INFO    ][32009] Executing command 'gluster volume info 'nova_instances' | grep 'cluster.readdir-optimize: On'' in directory '/root'
2017-10-29 09:35:43,340 [salt.state       ][INFO    ][32009] unless execution succeeded
2017-10-29 09:35:43,341 [salt.state       ][INFO    ][32009] Completed state [gluster volume set 'nova_instances' 'cluster.readdir-optimize' 'On'] at time 09:35:43.340661 duration_in_ms=52.873
2017-10-29 09:35:43,341 [salt.state       ][INFO    ][32009] Running state [gluster volume set 'nova_instances' 'network.remote-dio' 'On'] at time 09:35:43.341072
2017-10-29 09:35:43,341 [salt.state       ][INFO    ][32009] Executing state cmd.run for gluster volume set 'nova_instances' 'network.remote-dio' 'On'
2017-10-29 09:35:43,342 [salt.loaded.int.module.cmdmod][INFO    ][32009] Executing command 'gluster volume info 'nova_instances' | grep 'network.remote-dio: On'' in directory '/root'
2017-10-29 09:35:43,390 [salt.state       ][INFO    ][32009] unless execution succeeded
2017-10-29 09:35:43,390 [salt.state       ][INFO    ][32009] Completed state [gluster volume set 'nova_instances' 'network.remote-dio' 'On'] at time 09:35:43.390251 duration_in_ms=49.179
2017-10-29 09:35:43,391 [salt.state       ][INFO    ][32009] Running state [gluster volume set 'nova_instances' 'nfs.disable' 'On'] at time 09:35:43.390678
2017-10-29 09:35:43,391 [salt.state       ][INFO    ][32009] Executing state cmd.run for gluster volume set 'nova_instances' 'nfs.disable' 'On'
2017-10-29 09:35:43,391 [salt.loaded.int.module.cmdmod][INFO    ][32009] Executing command 'gluster volume info 'nova_instances' | grep 'nfs.disable: On'' in directory '/root'
2017-10-29 09:35:43,440 [salt.state       ][INFO    ][32009] unless execution succeeded
2017-10-29 09:35:43,440 [salt.state       ][INFO    ][32009] Completed state [gluster volume set 'nova_instances' 'nfs.disable' 'On'] at time 09:35:43.440058 duration_in_ms=49.38
2017-10-29 09:35:43,441 [salt.state       ][INFO    ][32009] Running state [gluster volume set 'nova_instances' 'diagnostics.client-log-level' 'WARNING'] at time 09:35:43.440494
2017-10-29 09:35:43,441 [salt.state       ][INFO    ][32009] Executing state cmd.run for gluster volume set 'nova_instances' 'diagnostics.client-log-level' 'WARNING'
2017-10-29 09:35:43,441 [salt.loaded.int.module.cmdmod][INFO    ][32009] Executing command 'gluster volume info 'nova_instances' | grep 'diagnostics.client-log-level: WARNING'' in directory '/root'
2017-10-29 09:35:43,490 [salt.state       ][INFO    ][32009] unless execution succeeded
2017-10-29 09:35:43,490 [salt.state       ][INFO    ][32009] Completed state [gluster volume set 'nova_instances' 'diagnostics.client-log-level' 'WARNING'] at time 09:35:43.489839 duration_in_ms=49.344
2017-10-29 09:35:43,491 [salt.state       ][INFO    ][32009] Running state [nova_instances] at time 09:35:43.490817
2017-10-29 09:35:43,491 [salt.state       ][INFO    ][32009] Executing state glusterfs.started for nova_instances
2017-10-29 09:35:43,491 [salt.loaded.int.module.cmdmod][INFO    ][32009] Executing command 'gluster --version' in directory '/root'
2017-10-29 09:35:43,500 [salt.loaded.int.module.cmdmod][INFO    ][32009] Executing command 'gluster --xml --mode=script' in directory '/root'
2017-10-29 09:35:43,548 [salt.loaded.int.module.cmdmod][INFO    ][32009] Executing command 'gluster --version' in directory '/root'
2017-10-29 09:35:43,556 [salt.loaded.int.module.cmdmod][INFO    ][32009] Executing command 'gluster --xml --mode=script' in directory '/root'
2017-10-29 09:35:43,609 [salt.state       ][INFO    ][32009] Volume nova_instances is already started
2017-10-29 09:35:43,609 [salt.state       ][INFO    ][32009] Completed state [nova_instances] at time 09:35:43.608743 duration_in_ms=117.926
2017-10-29 09:35:43,610 [salt.state       ][INFO    ][32009] Running state [keystone-credential-keys] at time 09:35:43.609622
2017-10-29 09:35:43,610 [salt.state       ][INFO    ][32009] Executing state glusterfs.created for keystone-credential-keys
2017-10-29 09:35:43,610 [salt.loaded.int.module.cmdmod][INFO    ][32009] Executing command 'gluster --version' in directory '/root'
2017-10-29 09:35:43,619 [salt.loaded.int.module.cmdmod][INFO    ][32009] Executing command 'gluster --xml --mode=script' in directory '/root'
2017-10-29 09:35:43,666 [salt.loaded.int.module.cmdmod][INFO    ][32009] Executing command 'gluster --version' in directory '/root'
2017-10-29 09:35:43,675 [salt.loaded.int.module.cmdmod][INFO    ][32009] Executing command 'gluster --xml --mode=script' in directory '/root'
2017-10-29 09:35:43,739 [salt.state       ][INFO    ][32009] Volume keystone-credential-keys already exists and is started.
2017-10-29 09:35:43,740 [salt.state       ][INFO    ][32009] Completed state [keystone-credential-keys] at time 09:35:43.739614 duration_in_ms=129.99
2017-10-29 09:35:43,743 [salt.state       ][INFO    ][32009] Running state [gluster volume set 'keystone-credential-keys' 'cluster.readdir-optimize' 'True'] at time 09:35:43.742593
2017-10-29 09:35:43,743 [salt.state       ][INFO    ][32009] Executing state cmd.run for gluster volume set 'keystone-credential-keys' 'cluster.readdir-optimize' 'True'
2017-10-29 09:35:43,743 [salt.loaded.int.module.cmdmod][INFO    ][32009] Executing command 'gluster volume info 'keystone-credential-keys' | grep 'cluster.readdir-optimize: True'' in directory '/root'
2017-10-29 09:35:43,794 [salt.state       ][INFO    ][32009] unless execution succeeded
2017-10-29 09:35:43,794 [salt.state       ][INFO    ][32009] Completed state [gluster volume set 'keystone-credential-keys' 'cluster.readdir-optimize' 'True'] at time 09:35:43.793864 duration_in_ms=51.271
2017-10-29 09:35:43,794 [salt.state       ][INFO    ][32009] Running state [gluster volume set 'keystone-credential-keys' 'diagnostics.brick-log-level' 'WARNING'] at time 09:35:43.794288
2017-10-29 09:35:43,795 [salt.state       ][INFO    ][32009] Executing state cmd.run for gluster volume set 'keystone-credential-keys' 'diagnostics.brick-log-level' 'WARNING'
2017-10-29 09:35:43,795 [salt.loaded.int.module.cmdmod][INFO    ][32009] Executing command 'gluster volume info 'keystone-credential-keys' | grep 'diagnostics.brick-log-level: WARNING'' in directory '/root'
2017-10-29 09:35:43,842 [salt.state       ][INFO    ][32009] unless execution succeeded
2017-10-29 09:35:43,843 [salt.state       ][INFO    ][32009] Completed state [gluster volume set 'keystone-credential-keys' 'diagnostics.brick-log-level' 'WARNING'] at time 09:35:43.842561 duration_in_ms=48.273
2017-10-29 09:35:43,843 [salt.state       ][INFO    ][32009] Running state [gluster volume set 'keystone-credential-keys' 'nfs.disable' 'True'] at time 09:35:43.843008
2017-10-29 09:35:43,843 [salt.state       ][INFO    ][32009] Executing state cmd.run for gluster volume set 'keystone-credential-keys' 'nfs.disable' 'True'
2017-10-29 09:35:43,844 [salt.loaded.int.module.cmdmod][INFO    ][32009] Executing command 'gluster volume info 'keystone-credential-keys' | grep 'nfs.disable: True'' in directory '/root'
2017-10-29 09:35:43,892 [salt.state       ][INFO    ][32009] unless execution succeeded
2017-10-29 09:35:43,892 [salt.state       ][INFO    ][32009] Completed state [gluster volume set 'keystone-credential-keys' 'nfs.disable' 'True'] at time 09:35:43.891934 duration_in_ms=48.926
2017-10-29 09:35:43,892 [salt.state       ][INFO    ][32009] Running state [gluster volume set 'keystone-credential-keys' 'diagnostics.client-log-level' 'WARNING'] at time 09:35:43.892393
2017-10-29 09:35:43,893 [salt.state       ][INFO    ][32009] Executing state cmd.run for gluster volume set 'keystone-credential-keys' 'diagnostics.client-log-level' 'WARNING'
2017-10-29 09:35:43,893 [salt.loaded.int.module.cmdmod][INFO    ][32009] Executing command 'gluster volume info 'keystone-credential-keys' | grep 'diagnostics.client-log-level: WARNING'' in directory '/root'
2017-10-29 09:35:43,942 [salt.state       ][INFO    ][32009] unless execution succeeded
2017-10-29 09:35:43,942 [salt.state       ][INFO    ][32009] Completed state [gluster volume set 'keystone-credential-keys' 'diagnostics.client-log-level' 'WARNING'] at time 09:35:43.941712 duration_in_ms=49.318
2017-10-29 09:35:43,942 [salt.state       ][INFO    ][32009] Running state [gluster volume set 'keystone-credential-keys' 'network.remote-dio' 'True'] at time 09:35:43.942157
2017-10-29 09:35:43,942 [salt.state       ][INFO    ][32009] Executing state cmd.run for gluster volume set 'keystone-credential-keys' 'network.remote-dio' 'True'
2017-10-29 09:35:43,943 [salt.loaded.int.module.cmdmod][INFO    ][32009] Executing command 'gluster volume info 'keystone-credential-keys' | grep 'network.remote-dio: True'' in directory '/root'
2017-10-29 09:35:43,990 [salt.state       ][INFO    ][32009] unless execution succeeded
2017-10-29 09:35:43,990 [salt.state       ][INFO    ][32009] Completed state [gluster volume set 'keystone-credential-keys' 'network.remote-dio' 'True'] at time 09:35:43.990329 duration_in_ms=48.172
2017-10-29 09:35:43,991 [salt.state       ][INFO    ][32009] Running state [keystone-credential-keys] at time 09:35:43.991244
2017-10-29 09:35:43,991 [salt.state       ][INFO    ][32009] Executing state glusterfs.started for keystone-credential-keys
2017-10-29 09:35:43,993 [salt.loaded.int.module.cmdmod][INFO    ][32009] Executing command 'gluster --version' in directory '/root'
2017-10-29 09:35:44,003 [salt.loaded.int.module.cmdmod][INFO    ][32009] Executing command 'gluster --xml --mode=script' in directory '/root'
2017-10-29 09:35:44,051 [salt.loaded.int.module.cmdmod][INFO    ][32009] Executing command 'gluster --version' in directory '/root'
2017-10-29 09:35:44,059 [salt.loaded.int.module.cmdmod][INFO    ][32009] Executing command 'gluster --xml --mode=script' in directory '/root'
2017-10-29 09:35:44,111 [salt.state       ][INFO    ][32009] Volume keystone-credential-keys is already started
2017-10-29 09:35:44,111 [salt.state       ][INFO    ][32009] Completed state [keystone-credential-keys] at time 09:35:44.111299 duration_in_ms=120.055
2017-10-29 09:35:44,113 [salt.minion      ][INFO    ][32009] Returning information for job: 20171029093540423764
2017-10-29 09:35:45,273 [salt.minion      ][INFO    ][24018] User sudo_ubuntu Executing command test.ping with jid 20171029093545262898
2017-10-29 09:35:45,288 [salt.minion      ][INFO    ][32409] Starting a new job with PID 32409
2017-10-29 09:35:45,315 [salt.minion      ][INFO    ][32409] Returning information for job: 20171029093545262898
2017-10-29 09:35:46,017 [salt.minion      ][INFO    ][24018] User sudo_ubuntu Executing command cmd.run with jid 20171029093546001984
2017-10-29 09:35:46,031 [salt.minion      ][INFO    ][32414] Starting a new job with PID 32414
2017-10-29 09:35:46,035 [salt.loaded.int.module.cmdmod][INFO    ][32414] Executing command 'gluster peer status; gluster volume status' in directory '/root'
2017-10-29 09:35:46,145 [salt.minion      ][INFO    ][32414] Returning information for job: 20171029093546001984
2017-10-29 09:47:49,915 [salt.utils.schedule][INFO    ][24018] Running scheduled job: __mine_interval
2017-10-29 10:47:49,915 [salt.utils.schedule][INFO    ][24018] Running scheduled job: __mine_interval
2017-10-29 10:57:21,961 [salt.minion      ][INFO    ][24018] User sudo_ubuntu Executing command cp.push_dir with jid 20171029105721942828
2017-10-29 10:57:21,980 [salt.minion      ][INFO    ][1179] Starting a new job with PID 1179
