2017-09-14 19:35:28,746 [salt.utils       ][ERROR   ][3911] DNS lookup or connection check of 'salt' failed.
2017-09-14 19:35:28,747 [salt.minion      ][ERROR   ][3911] Master hostname: 'salt' not found or not responsive. Retrying in 30 seconds
2017-09-14 19:35:30,347 [salt.utils.parsers][WARNING ][3911] Minion received a SIGTERM. Exiting.
2017-09-14 19:36:11,674 [salt.minion      ][ERROR   ][4037] Error while bringing up minion for multi-master. Is master at 10.20.0.2 responding?
2017-09-14 19:37:01,718 [salt.minion      ][ERROR   ][4037] Error while bringing up minion for multi-master. Is master at 10.20.0.2 responding?
2017-09-14 19:39:41,689 [salt.utils.parsers][WARNING ][16220] Minion received a SIGTERM. Exiting.
2017-09-14 19:39:54,661 [py.warnings      ][WARNING ][23611] /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-09-14 19:40:26,003 [salt.loaded.int.states.file][WARNING ][23611] State for file: /etc/pki/ca/salt_master_ca/ca.crt - Neither 'source' nor 'contents' nor 'contents_pillar' nor 'contents_grains' was defined, yet 'replace' was set to 'True'. As there is no source to replace the file with, 'replace' has been set to 'False' to avoid reading the file unnecessarily.
2017-09-14 19:40:40,475 [salt.loaded.int.module.cmdmod][ERROR   ][23611] 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-09-14 19:40:45,193 [salt.loaded.int.module.cmdmod][INFO    ][30016] Executing command ['systemctl', 'status', 'salt-minion.service', '-n', '0'] in directory '/root'
2017-09-14 19:40:45,201 [salt.loaded.int.module.cmdmod][INFO    ][30016] Executing command ['systemctl', 'is-enabled', 'salt-minion.service'] in directory '/root'
2017-09-14 19:40:45,209 [salt.loaded.int.module.cmdmod][INFO    ][30016] Executing command ['systemd-run', '--scope', 'systemctl', 'restart', 'salt-minion.service'] in directory '/root'
2017-09-14 19:40:45,228 [salt.utils.parsers][WARNING ][23298] Minion received a SIGTERM. Exiting.
2017-09-14 19:40:46,095 [salt.cli.daemons ][INFO    ][30118] Setting up the Salt Minion "cfg01.baremetal-mcp-ocata-odl-ha.local"
2017-09-14 19:40:46,196 [salt.cli.daemons ][INFO    ][30118] Starting up the Salt Minion
2017-09-14 19:40:46,197 [salt.utils.event ][INFO    ][30118] Starting pull socket on /var/run/salt/minion/minion_event_d39b300263_pull.ipc
2017-09-14 19:40:46,641 [salt.minion      ][INFO    ][30118] Creating minion process manager
2017-09-14 19:40:47,644 [salt.loader.10.20.0.2.int.module.cmdmod][INFO    ][30118] Executing command ['date', '+%z'] in directory '/root'
2017-09-14 19:40:47,657 [salt.utils.schedule][INFO    ][30118] Updating job settings for scheduled job: __mine_interval
2017-09-14 19:40:47,662 [salt.minion      ][INFO    ][30118] Added mine.update to scheduler
2017-09-14 19:40:47,682 [salt.minion      ][INFO    ][30118] Minion is starting as user 'root'
2017-09-14 19:40:47,699 [salt.minion      ][INFO    ][30118] Minion is ready to receive requests!
2017-09-14 19:40:48,701 [salt.utils.schedule][INFO    ][30118] Running scheduled job: __mine_interval
2017-09-14 19:40:55,370 [salt.minion      ][INFO    ][30118] User sudo_ubuntu Executing command saltutil.find_job with jid 20170914194055351503
2017-09-14 19:40:55,393 [salt.minion      ][INFO    ][30215] Starting a new job with PID 30215
2017-09-14 19:40:55,411 [salt.minion      ][INFO    ][30215] Returning information for job: 20170914194055351503
2017-09-14 19:41:05,437 [salt.minion      ][INFO    ][30118] User sudo_ubuntu Executing command saltutil.find_job with jid 20170914194105424833
2017-09-14 19:41:05,459 [salt.minion      ][INFO    ][30253] Starting a new job with PID 30253
2017-09-14 19:41:05,480 [salt.minion      ][INFO    ][30253] Returning information for job: 20170914194105424833
2017-09-14 19:41:16,010 [salt.minion      ][INFO    ][30118] User sudo_ubuntu Executing command state.apply with jid 20170914194116002080
2017-09-14 19:41:16,026 [salt.minion      ][INFO    ][30283] Starting a new job with PID 30283
2017-09-14 19:41:17,581 [salt.state       ][INFO    ][30283] Loading fresh modules for state activity
2017-09-14 19:41:18,585 [salt.loaded.int.module.cmdmod][INFO    ][30283] Executing command 'reclass --version' in directory '/root'
2017-09-14 19:41:18,879 [py.warnings      ][WARNING ][30283] /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-09-14 19:41:18,880 [salt.loaded.int.module.cmdmod][INFO    ][30283] Executing command 'salt-minion --version' in directory '/root'
2017-09-14 19:41:19,207 [salt.loaded.int.module.cmdmod][INFO    ][30283] Executing command 'salt --version' in directory '/root'
2017-09-14 19:41:19,948 [salt.loaded.int.module.cmdmod][INFO    ][30283] Executing command 'reclass --version' in directory '/root'
2017-09-14 19:41:20,152 [salt.loaded.int.module.cmdmod][INFO    ][30283] Executing command 'salt-minion --version' in directory '/root'
2017-09-14 19:41:20,349 [salt.loaded.int.module.cmdmod][INFO    ][30283] Executing command 'salt --version' in directory '/root'
2017-09-14 19:41:21,272 [salt.state       ][INFO    ][30283] Running state [salt-master] at time 19:41:21.272339
2017-09-14 19:41:21,272 [salt.state       ][INFO    ][30283] Executing state pkg.installed for salt-master
2017-09-14 19:41:21,273 [salt.loaded.int.module.cmdmod][INFO    ][30283] Executing command ['dpkg-query', '--showformat', '${Status} ${Package} ${Version} ${Architecture}\n', '-W'] in directory '/root'
2017-09-14 19:41:21,540 [salt.state       ][INFO    ][30283] Package salt-master is already installed
2017-09-14 19:41:21,541 [salt.state       ][INFO    ][30283] Completed state [salt-master] at time 19:41:21.541096 duration_in_ms=268.757
2017-09-14 19:41:21,543 [salt.state       ][INFO    ][30283] Running state [/etc/salt/master.d/master.conf] at time 19:41:21.543805
2017-09-14 19:41:21,544 [salt.state       ][INFO    ][30283] Executing state file.managed for /etc/salt/master.d/master.conf
2017-09-14 19:41:21,810 [salt.state       ][INFO    ][30283] File /etc/salt/master.d/master.conf is in the correct state
2017-09-14 19:41:21,811 [salt.state       ][INFO    ][30283] Completed state [/etc/salt/master.d/master.conf] at time 19:41:21.811182 duration_in_ms=267.376
2017-09-14 19:41:21,812 [salt.state       ][INFO    ][30283] Running state [/etc/salt/master.d/_acl.conf] at time 19:41:21.812559
2017-09-14 19:41:21,813 [salt.state       ][INFO    ][30283] Executing state file.managed for /etc/salt/master.d/_acl.conf
2017-09-14 19:41:21,905 [salt.state       ][INFO    ][30283] File /etc/salt/master.d/_acl.conf is in the correct state
2017-09-14 19:41:21,905 [salt.state       ][INFO    ][30283] Completed state [/etc/salt/master.d/_acl.conf] at time 19:41:21.905407 duration_in_ms=92.847
2017-09-14 19:41:21,906 [salt.state       ][INFO    ][30283] Running state [/etc/salt/master.d/_peer.conf] at time 19:41:21.906316
2017-09-14 19:41:21,906 [salt.state       ][INFO    ][30283] Executing state file.managed for /etc/salt/master.d/_peer.conf
2017-09-14 19:41:21,984 [salt.state       ][INFO    ][30283] File /etc/salt/master.d/_peer.conf is in the correct state
2017-09-14 19:41:21,984 [salt.state       ][INFO    ][30283] Completed state [/etc/salt/master.d/_peer.conf] at time 19:41:21.984337 duration_in_ms=78.021
2017-09-14 19:41:21,986 [salt.state       ][INFO    ][30283] Running state [salt-master] at time 19:41:21.986649
2017-09-14 19:41:21,986 [salt.state       ][INFO    ][30283] Executing state service.running for salt-master
2017-09-14 19:41:21,987 [salt.loaded.int.module.cmdmod][INFO    ][30283] Executing command ['systemctl', 'status', 'salt-master.service', '-n', '0'] in directory '/root'
2017-09-14 19:41:22,012 [salt.loaded.int.module.cmdmod][INFO    ][30283] Executing command ['systemctl', 'is-active', 'salt-master.service'] in directory '/root'
2017-09-14 19:41:22,024 [salt.loaded.int.module.cmdmod][INFO    ][30283] Executing command ['systemctl', 'is-enabled', 'salt-master.service'] in directory '/root'
2017-09-14 19:41:22,034 [salt.state       ][INFO    ][30283] The service salt-master is already running
2017-09-14 19:41:22,035 [salt.state       ][INFO    ][30283] Completed state [salt-master] at time 19:41:22.035369 duration_in_ms=48.719
2017-09-14 19:41:22,036 [salt.state       ][INFO    ][30283] Running state [/srv/salt/env] at time 19:41:22.036235
2017-09-14 19:41:22,037 [salt.state       ][INFO    ][30283] Executing state file.directory for /srv/salt/env
2017-09-14 19:41:22,038 [salt.state       ][INFO    ][30283] Directory /srv/salt/env is in the correct state
2017-09-14 19:41:22,039 [salt.state       ][INFO    ][30283] Completed state [/srv/salt/env] at time 19:41:22.039294 duration_in_ms=3.059
2017-09-14 19:41:22,041 [salt.state       ][INFO    ][30283] Running state [salt] at time 19:41:22.041663
2017-09-14 19:41:22,042 [salt.state       ][INFO    ][30283] Executing state user.present for salt
2017-09-14 19:41:22,044 [salt.state       ][INFO    ][30283] User salt is present and up to date
2017-09-14 19:41:22,045 [salt.state       ][INFO    ][30283] Completed state [salt] at time 19:41:22.045232 duration_in_ms=3.569
2017-09-14 19:41:22,047 [salt.state       ][INFO    ][30283] Running state [/var/tmp/salt] at time 19:41:22.047258
2017-09-14 19:41:22,047 [salt.state       ][INFO    ][30283] Executing state file.directory for /var/tmp/salt
2017-09-14 19:41:22,049 [salt.state       ][INFO    ][30283] Directory /var/tmp/salt is in the correct state
2017-09-14 19:41:22,049 [salt.state       ][INFO    ][30283] Completed state [/var/tmp/salt] at time 19:41:22.049772 duration_in_ms=2.515
2017-09-14 19:41:22,050 [salt.state       ][INFO    ][30283] Running state [/etc/sudoers.d/90-salt-user-salt] at time 19:41:22.050372
2017-09-14 19:41:22,051 [salt.state       ][INFO    ][30283] Executing state file.absent for /etc/sudoers.d/90-salt-user-salt
2017-09-14 19:41:22,051 [salt.state       ][INFO    ][30283] File /etc/sudoers.d/90-salt-user-salt is not present
2017-09-14 19:41:22,052 [salt.state       ][INFO    ][30283] Completed state [/etc/sudoers.d/90-salt-user-salt] at time 19:41:22.052238 duration_in_ms=1.867
2017-09-14 19:41:22,052 [salt.state       ][INFO    ][30283] Running state [root] at time 19:41:22.052863
2017-09-14 19:41:22,053 [salt.state       ][INFO    ][30283] Executing state user.present for root
2017-09-14 19:41:22,055 [salt.state       ][INFO    ][30283] User root is present and up to date
2017-09-14 19:41:22,055 [salt.state       ][INFO    ][30283] Completed state [root] at time 19:41:22.055640 duration_in_ms=2.778
2017-09-14 19:41:22,057 [salt.state       ][INFO    ][30283] Running state [/root] at time 19:41:22.057411
2017-09-14 19:41:22,058 [salt.state       ][INFO    ][30283] Executing state file.directory for /root
2017-09-14 19:41:22,059 [salt.state       ][INFO    ][30283] Directory /root is in the correct state
2017-09-14 19:41:22,059 [salt.state       ][INFO    ][30283] Completed state [/root] at time 19:41:22.059627 duration_in_ms=2.216
2017-09-14 19:41:22,060 [salt.state       ][INFO    ][30283] Running state [/etc/sudoers.d/90-salt-user-root] at time 19:41:22.060225
2017-09-14 19:41:22,060 [salt.state       ][INFO    ][30283] Executing state file.absent for /etc/sudoers.d/90-salt-user-root
2017-09-14 19:41:22,061 [salt.state       ][INFO    ][30283] File /etc/sudoers.d/90-salt-user-root is not present
2017-09-14 19:41:22,062 [salt.state       ][INFO    ][30283] Completed state [/etc/sudoers.d/90-salt-user-root] at time 19:41:22.062055 duration_in_ms=1.831
2017-09-14 19:41:22,062 [salt.state       ][INFO    ][30283] Running state [ubuntu] at time 19:41:22.062651
2017-09-14 19:41:22,063 [salt.state       ][INFO    ][30283] Executing state user.present for ubuntu
2017-09-14 19:41:22,064 [salt.state       ][INFO    ][30283] User ubuntu is present and up to date
2017-09-14 19:41:22,065 [salt.state       ][INFO    ][30283] Completed state [ubuntu] at time 19:41:22.065469 duration_in_ms=2.818
2017-09-14 19:41:22,068 [salt.state       ][INFO    ][30283] Running state [/home/ubuntu] at time 19:41:22.068188
2017-09-14 19:41:22,068 [salt.state       ][INFO    ][30283] Executing state file.directory for /home/ubuntu
2017-09-14 19:41:22,070 [salt.state       ][INFO    ][30283] Directory /home/ubuntu is in the correct state
2017-09-14 19:41:22,070 [salt.state       ][INFO    ][30283] Completed state [/home/ubuntu] at time 19:41:22.070513 duration_in_ms=2.325
2017-09-14 19:41:22,071 [salt.state       ][INFO    ][30283] Running state [/etc/sudoers.d/90-salt-user-ubuntu] at time 19:41:22.071893
2017-09-14 19:41:22,072 [salt.state       ][INFO    ][30283] Executing state file.managed for /etc/sudoers.d/90-salt-user-ubuntu
2017-09-14 19:41:22,092 [salt.state       ][INFO    ][30283] File /etc/sudoers.d/90-salt-user-ubuntu is in the correct state
2017-09-14 19:41:22,092 [salt.state       ][INFO    ][30283] Completed state [/etc/sudoers.d/90-salt-user-ubuntu] at time 19:41:22.092605 duration_in_ms=20.711
2017-09-14 19:41:22,093 [salt.state       ][INFO    ][30283] Running state [git-core] at time 19:41:22.093208
2017-09-14 19:41:22,093 [salt.state       ][INFO    ][30283] Executing state pkg.installed for git-core
2017-09-14 19:41:22,102 [salt.state       ][INFO    ][30283] Package git-core is already installed
2017-09-14 19:41:22,102 [salt.state       ][INFO    ][30283] Completed state [git-core] at time 19:41:22.102713 duration_in_ms=9.505
2017-09-14 19:41:22,103 [salt.state       ][INFO    ][30283] Running state [/usr/share/salt-formulas/env/_grains] at time 19:41:22.103250
2017-09-14 19:41:22,103 [salt.state       ][INFO    ][30283] Executing state file.directory for /usr/share/salt-formulas/env/_grains
2017-09-14 19:41:22,104 [salt.state       ][INFO    ][30283] Directory /usr/share/salt-formulas/env/_grains is in the correct state
2017-09-14 19:41:22,105 [salt.state       ][INFO    ][30283] Completed state [/usr/share/salt-formulas/env/_grains] at time 19:41:22.105232 duration_in_ms=1.983
2017-09-14 19:41:22,105 [salt.state       ][INFO    ][30283] Running state [/usr/share/salt-formulas/env/_modules] at time 19:41:22.105753
2017-09-14 19:41:22,106 [salt.state       ][INFO    ][30283] Executing state file.directory for /usr/share/salt-formulas/env/_modules
2017-09-14 19:41:22,107 [salt.state       ][INFO    ][30283] Directory /usr/share/salt-formulas/env/_modules is in the correct state
2017-09-14 19:41:22,107 [salt.state       ][INFO    ][30283] Completed state [/usr/share/salt-formulas/env/_modules] at time 19:41:22.107599 duration_in_ms=1.846
2017-09-14 19:41:22,108 [salt.state       ][INFO    ][30283] Running state [/usr/share/salt-formulas/env/_formulas] at time 19:41:22.108125
2017-09-14 19:41:22,108 [salt.state       ][INFO    ][30283] Executing state file.directory for /usr/share/salt-formulas/env/_formulas
2017-09-14 19:41:22,109 [salt.state       ][INFO    ][30283] Directory /usr/share/salt-formulas/env/_formulas is in the correct state
2017-09-14 19:41:22,110 [salt.state       ][INFO    ][30283] Completed state [/usr/share/salt-formulas/env/_formulas] at time 19:41:22.110038 duration_in_ms=1.912
2017-09-14 19:41:22,110 [salt.state       ][INFO    ][30283] Running state [/usr/share/salt-formulas/env/_states] at time 19:41:22.110547
2017-09-14 19:41:22,111 [salt.state       ][INFO    ][30283] Executing state file.directory for /usr/share/salt-formulas/env/_states
2017-09-14 19:41:22,111 [salt.state       ][INFO    ][30283] Directory /usr/share/salt-formulas/env/_states is in the correct state
2017-09-14 19:41:22,112 [salt.state       ][INFO    ][30283] Completed state [/usr/share/salt-formulas/env/_states] at time 19:41:22.112475 duration_in_ms=1.927
2017-09-14 19:41:22,114 [salt.state       ][INFO    ][30283] Running state [/srv/salt/env/prd] at time 19:41:22.114016
2017-09-14 19:41:22,114 [salt.state       ][INFO    ][30283] Executing state file.symlink for /srv/salt/env/prd
2017-09-14 19:41:22,116 [salt.state       ][INFO    ][30283] Symlink /srv/salt/env/prd is present and owned by root:root
2017-09-14 19:41:22,116 [salt.state       ][INFO    ][30283] Completed state [/srv/salt/env/prd] at time 19:41:22.116754 duration_in_ms=2.738
2017-09-14 19:41:22,117 [salt.state       ][INFO    ][30283] Running state [salt_master_prd_pkg_formulas] at time 19:41:22.117272
2017-09-14 19:41:22,117 [salt.state       ][INFO    ][30283] Executing state pkg.latest for salt_master_prd_pkg_formulas
2017-09-14 19:41:22,131 [salt.loaded.int.module.cmdmod][INFO    ][30283] Executing command ['apt-cache', '-q', 'policy', 'salt-formula-maas'] in directory '/root'
2017-09-14 19:41:22,188 [salt.loaded.int.module.cmdmod][INFO    ][30283] Executing command ['apt-cache', '-q', 'policy', 'salt-formula-grafana'] in directory '/root'
2017-09-14 19:41:22,266 [salt.loaded.int.module.cmdmod][INFO    ][30283] Executing command ['apt-cache', '-q', 'policy', 'salt-formula-xtrabackup'] in directory '/root'
2017-09-14 19:41:22,319 [salt.loaded.int.module.cmdmod][INFO    ][30283] Executing command ['apt-cache', '-q', 'policy', 'salt-formula-docker'] in directory '/root'
2017-09-14 19:41:22,387 [salt.loaded.int.module.cmdmod][INFO    ][30283] Executing command ['apt-cache', '-q', 'policy', 'salt-formula-heat'] in directory '/root'
2017-09-14 19:41:22,457 [salt.loaded.int.module.cmdmod][INFO    ][30283] Executing command ['apt-cache', '-q', 'policy', 'salt-formula-reclass'] in directory '/root'
2017-09-14 19:41:22,509 [salt.loaded.int.module.cmdmod][INFO    ][30283] Executing command ['apt-cache', '-q', 'policy', 'salt-formula-redis'] in directory '/root'
2017-09-14 19:41:22,551 [salt.loaded.int.module.cmdmod][INFO    ][30283] Executing command ['apt-cache', '-q', 'policy', 'salt-formula-nova'] in directory '/root'
2017-09-14 19:41:22,637 [salt.loaded.int.module.cmdmod][INFO    ][30283] Executing command ['apt-cache', '-q', 'policy', 'salt-formula-iptables'] in directory '/root'
2017-09-14 19:41:22,674 [salt.loaded.int.module.cmdmod][INFO    ][30283] Executing command ['apt-cache', '-q', 'policy', 'salt-formula-murano'] in directory '/root'
2017-09-14 19:41:22,710 [salt.loaded.int.module.cmdmod][INFO    ][30283] Executing command ['apt-cache', '-q', 'policy', 'salt-formula-glusterfs'] in directory '/root'
2017-09-14 19:41:22,751 [salt.loaded.int.module.cmdmod][INFO    ][30283] Executing command ['apt-cache', '-q', 'policy', 'salt-formula-backupninja'] in directory '/root'
2017-09-14 19:41:22,795 [salt.loaded.int.module.cmdmod][INFO    ][30283] Executing command ['apt-cache', '-q', 'policy', 'salt-formula-kubernetes'] in directory '/root'
2017-09-14 19:41:22,905 [salt.loaded.int.module.cmdmod][INFO    ][30283] Executing command ['apt-cache', '-q', 'policy', 'salt-formula-linux'] in directory '/root'
2017-09-14 19:41:22,994 [salt.loaded.int.module.cmdmod][INFO    ][30283] Executing command ['apt-cache', '-q', 'policy', 'salt-formula-git'] in directory '/root'
2017-09-14 19:41:23,031 [salt.loaded.int.module.cmdmod][INFO    ][30283] Executing command ['apt-cache', '-q', 'policy', 'salt-formula-supervisor'] in directory '/root'
2017-09-14 19:41:23,065 [salt.loaded.int.module.cmdmod][INFO    ][30283] Executing command ['apt-cache', '-q', 'policy', 'salt-formula-aptly'] in directory '/root'
2017-09-14 19:41:23,106 [salt.loaded.int.module.cmdmod][INFO    ][30283] Executing command ['apt-cache', '-q', 'policy', 'salt-formula-gerrit'] in directory '/root'
2017-09-14 19:41:23,145 [salt.loaded.int.module.cmdmod][INFO    ][30283] Executing command ['apt-cache', '-q', 'policy', 'salt-formula-cassandra'] in directory '/root'
2017-09-14 19:41:23,178 [salt.loaded.int.module.cmdmod][INFO    ][30283] Executing command ['apt-cache', '-q', 'policy', 'salt-formula-aptcacher'] in directory '/root'
2017-09-14 19:41:23,212 [salt.loaded.int.module.cmdmod][INFO    ][30283] Executing command ['apt-cache', '-q', 'policy', 'salt-formula-glance'] in directory '/root'
2017-09-14 19:41:23,279 [salt.loaded.int.module.cmdmod][INFO    ][30283] Executing command ['apt-cache', '-q', 'policy', 'salt-formula-heka'] in directory '/root'
2017-09-14 19:41:23,344 [salt.loaded.int.module.cmdmod][INFO    ][30283] Executing command ['apt-cache', '-q', 'policy', 'salt-formula-keystone'] in directory '/root'
2017-09-14 19:41:23,420 [salt.loaded.int.module.cmdmod][INFO    ][30283] Executing command ['apt-cache', '-q', 'policy', 'salt-formula-ntp'] in directory '/root'
2017-09-14 19:41:23,459 [salt.loaded.int.module.cmdmod][INFO    ][30283] Executing command ['apt-cache', '-q', 'policy', 'salt-formula-memcached'] in directory '/root'
2017-09-14 19:41:23,504 [salt.loaded.int.module.cmdmod][INFO    ][30283] Executing command ['apt-cache', '-q', 'policy', 'salt-formula-aodh'] in directory '/root'
2017-09-14 19:41:23,578 [salt.loaded.int.module.cmdmod][INFO    ][30283] Executing command ['apt-cache', '-q', 'policy', 'salt-formula-python'] in directory '/root'
2017-09-14 19:41:23,631 [salt.loaded.int.module.cmdmod][INFO    ][30283] Executing command ['apt-cache', '-q', 'policy', 'salt-formula-collectd'] in directory '/root'
2017-09-14 19:41:23,704 [salt.loaded.int.module.cmdmod][INFO    ][30283] Executing command ['apt-cache', '-q', 'policy', 'salt-formula-neutron'] in directory '/root'
2017-09-14 19:41:23,791 [salt.loaded.int.module.cmdmod][INFO    ][30283] Executing command ['apt-cache', '-q', 'policy', 'salt-formula-apache'] in directory '/root'
2017-09-14 19:41:23,833 [salt.loaded.int.module.cmdmod][INFO    ][30283] Executing command ['apt-cache', '-q', 'policy', 'salt-formula-ceilometer'] in directory '/root'
2017-09-14 19:41:23,894 [salt.loaded.int.module.cmdmod][INFO    ][30283] Executing command ['apt-cache', '-q', 'policy', 'salt-formula-elasticsearch'] in directory '/root'
2017-09-14 19:41:23,937 [salt.loaded.int.module.cmdmod][INFO    ][30283] Executing command ['apt-cache', '-q', 'policy', 'salt-formula-powerdns'] in directory '/root'
2017-09-14 19:41:23,971 [salt.loaded.int.module.cmdmod][INFO    ][30283] Executing command ['apt-cache', '-q', 'policy', 'salt-formula-sensu'] in directory '/root'
2017-09-14 19:41:24,020 [salt.loaded.int.module.cmdmod][INFO    ][30283] Executing command ['apt-cache', '-q', 'policy', 'salt-formula-libvirt'] in directory '/root'
2017-09-14 19:41:24,067 [salt.loaded.int.module.cmdmod][INFO    ][30283] Executing command ['apt-cache', '-q', 'policy', 'salt-formula-sahara'] in directory '/root'
2017-09-14 19:41:24,102 [salt.loaded.int.module.cmdmod][INFO    ][30283] Executing command ['apt-cache', '-q', 'policy', 'salt-formula-openssh'] in directory '/root'
2017-09-14 19:41:24,148 [salt.loaded.int.module.cmdmod][INFO    ][30283] Executing command ['apt-cache', '-q', 'policy', 'salt-formula-statsd'] in directory '/root'
2017-09-14 19:41:24,191 [salt.loaded.int.module.cmdmod][INFO    ][30283] Executing command ['apt-cache', '-q', 'policy', 'salt-formula-mongodb'] in directory '/root'
2017-09-14 19:41:24,229 [salt.loaded.int.module.cmdmod][INFO    ][30283] Executing command ['apt-cache', '-q', 'policy', 'salt-formula-kibana'] in directory '/root'
2017-09-14 19:41:24,281 [salt.loaded.int.module.cmdmod][INFO    ][30283] Executing command ['apt-cache', '-q', 'policy', 'salt-formula-sphinx'] in directory '/root'
2017-09-14 19:41:24,318 [salt.loaded.int.module.cmdmod][INFO    ][30283] Executing command ['apt-cache', '-q', 'policy', 'salt-formula-freeipa'] in directory '/root'
2017-09-14 19:41:24,353 [salt.loaded.int.module.cmdmod][INFO    ][30283] Executing command ['apt-cache', '-q', 'policy', 'salt-formula-octavia'] in directory '/root'
2017-09-14 19:41:24,394 [salt.loaded.int.module.cmdmod][INFO    ][30283] Executing command ['apt-cache', '-q', 'policy', 'salt-formula-bind'] in directory '/root'
2017-09-14 19:41:24,429 [salt.loaded.int.module.cmdmod][INFO    ][30283] Executing command ['apt-cache', '-q', 'policy', 'salt-formula-salt'] in directory '/root'
2017-09-14 19:41:24,497 [salt.loaded.int.module.cmdmod][INFO    ][30283] Executing command ['apt-cache', '-q', 'policy', 'salt-formula-etcd'] in directory '/root'
2017-09-14 19:41:24,545 [salt.loaded.int.module.cmdmod][INFO    ][30283] Executing command ['apt-cache', '-q', 'policy', 'salt-formula-devops-portal'] in directory '/root'
2017-09-14 19:41:24,582 [salt.loaded.int.module.cmdmod][INFO    ][30283] Executing command ['apt-cache', '-q', 'policy', 'salt-formula-postgresql'] in directory '/root'
2017-09-14 19:41:24,633 [salt.loaded.int.module.cmdmod][INFO    ][30283] Executing command ['apt-cache', '-q', 'policy', 'salt-formula-nginx'] in directory '/root'
2017-09-14 19:41:24,675 [salt.loaded.int.module.cmdmod][INFO    ][30283] Executing command ['apt-cache', '-q', 'policy', 'salt-formula-mysql'] in directory '/root'
2017-09-14 19:41:24,713 [salt.loaded.int.module.cmdmod][INFO    ][30283] Executing command ['apt-cache', '-q', 'policy', 'salt-formula-ceph'] in directory '/root'
2017-09-14 19:41:24,760 [salt.loaded.int.module.cmdmod][INFO    ][30283] Executing command ['apt-cache', '-q', 'policy', 'salt-formula-horizon'] in directory '/root'
2017-09-14 19:41:24,824 [salt.loaded.int.module.cmdmod][INFO    ][30283] Executing command ['apt-cache', '-q', 'policy', 'salt-formula-haproxy'] in directory '/root'
2017-09-14 19:41:24,869 [salt.loaded.int.module.cmdmod][INFO    ][30283] Executing command ['apt-cache', '-q', 'policy', 'salt-formula-java'] in directory '/root'
2017-09-14 19:41:24,903 [salt.loaded.int.module.cmdmod][INFO    ][30283] Executing command ['apt-cache', '-q', 'policy', 'salt-formula-billometer'] in directory '/root'
2017-09-14 19:41:24,936 [salt.loaded.int.module.cmdmod][INFO    ][30283] Executing command ['apt-cache', '-q', 'policy', 'salt-formula-telegraf'] in directory '/root'
2017-09-14 19:41:24,983 [salt.loaded.int.module.cmdmod][INFO    ][30283] Executing command ['apt-cache', '-q', 'policy', 'salt-formula-designate'] in directory '/root'
2017-09-14 19:41:25,019 [salt.loaded.int.module.cmdmod][INFO    ][30283] Executing command ['apt-cache', '-q', 'policy', 'salt-formula-keepalived'] in directory '/root'
2017-09-14 19:41:25,059 [salt.loaded.int.module.cmdmod][INFO    ][30283] Executing command ['apt-cache', '-q', 'policy', 'salt-formula-rundeck'] in directory '/root'
2017-09-14 19:41:25,096 [salt.loaded.int.module.cmdmod][INFO    ][30283] Executing command ['apt-cache', '-q', 'policy', 'salt-formula-ccp'] in directory '/root'
2017-09-14 19:41:25,129 [salt.loaded.int.module.cmdmod][INFO    ][30283] Executing command ['apt-cache', '-q', 'policy', 'salt-formula-cinder'] in directory '/root'
2017-09-14 19:41:25,201 [salt.loaded.int.module.cmdmod][INFO    ][30283] Executing command ['apt-cache', '-q', 'policy', 'salt-formula-rabbitmq'] in directory '/root'
2017-09-14 19:41:25,243 [salt.loaded.int.module.cmdmod][INFO    ][30283] Executing command ['apt-cache', '-q', 'policy', 'salt-formula-openldap'] in directory '/root'
2017-09-14 19:41:25,277 [salt.loaded.int.module.cmdmod][INFO    ][30283] Executing command ['apt-cache', '-q', 'policy', 'salt-formula-influxdb'] in directory '/root'
2017-09-14 19:41:25,347 [salt.loaded.int.module.cmdmod][INFO    ][30283] Executing command ['apt-cache', '-q', 'policy', 'salt-formula-helm'] in directory '/root'
2017-09-14 19:41:25,409 [salt.loaded.int.module.cmdmod][INFO    ][30283] Executing command ['apt-cache', '-q', 'policy', 'salt-formula-opencontrail'] in directory '/root'
2017-09-14 19:41:25,503 [salt.loaded.int.module.cmdmod][INFO    ][30283] Executing command ['apt-cache', '-q', 'policy', 'salt-formula-jenkins'] in directory '/root'
2017-09-14 19:41:25,580 [salt.loaded.int.module.cmdmod][INFO    ][30283] Executing command ['apt-cache', '-q', 'policy', 'salt-formula-lldp'] in directory '/root'
2017-09-14 19:41:25,617 [salt.loaded.int.module.cmdmod][INFO    ][30283] Executing command ['apt-cache', '-q', 'policy', 'salt-formula-nagios'] in directory '/root'
2017-09-14 19:41:25,660 [salt.loaded.int.module.cmdmod][INFO    ][30283] Executing command ['apt-cache', '-q', 'policy', 'salt-formula-swift'] in directory '/root'
2017-09-14 19:41:25,711 [salt.loaded.int.module.cmdmod][INFO    ][30283] Executing command ['apt-cache', '-q', 'policy', 'salt-formula-zookeeper'] in directory '/root'
2017-09-14 19:41:25,747 [salt.loaded.int.module.cmdmod][INFO    ][30283] Executing command ['apt-cache', '-q', 'policy', 'salt-formula-galera'] in directory '/root'
2017-09-14 19:41:25,795 [salt.loaded.int.module.cmdmod][INFO    ][30283] Executing command ['apt-cache', '-q', 'policy', 'salt-formula-graphite'] in directory '/root'
2017-09-14 19:41:25,829 [salt.loaded.int.module.cmdmod][INFO    ][30283] Executing command ['apt-cache', '-q', 'policy', 'salt-formula-prometheus'] in directory '/root'
2017-09-14 19:41:25,879 [salt.loaded.int.module.cmdmod][INFO    ][30283] Executing command ['apt-cache', '-q', 'policy', 'salt-formula-rsyslog'] in directory '/root'
2017-09-14 19:41:25,920 [salt.state       ][INFO    ][30283] All 75 packages are up-to-date.
2017-09-14 19:41:25,920 [salt.state       ][INFO    ][30283] Completed state [salt_master_prd_pkg_formulas] at time 19:41:25.920644 duration_in_ms=3803.371
2017-09-14 19:41:25,920 [salt.state       ][INFO    ][30283] Running state [/srv/salt/reclass] at time 19:41:25.920899
2017-09-14 19:41:25,921 [salt.state       ][INFO    ][30283] Executing state file.directory for /srv/salt/reclass
2017-09-14 19:41:25,921 [salt.state       ][INFO    ][30283] Directory /srv/salt/reclass is in the correct state
2017-09-14 19:41:25,921 [salt.state       ][INFO    ][30283] Completed state [/srv/salt/reclass] at time 19:41:25.921814 duration_in_ms=0.915
2017-09-14 19:41:25,923 [salt.state       ][INFO    ][30283] Running state [/srv/salt/reclass/classes/service] at time 19:41:25.923040
2017-09-14 19:41:25,923 [salt.state       ][INFO    ][30283] Executing state file.directory for /srv/salt/reclass/classes/service
2017-09-14 19:41:25,923 [salt.state       ][INFO    ][30283] Directory /srv/salt/reclass/classes/service is in the correct state
2017-09-14 19:41:25,923 [salt.state       ][INFO    ][30283] Completed state [/srv/salt/reclass/classes/service] at time 19:41:25.923700 duration_in_ms=0.661
2017-09-14 19:41:25,924 [salt.state       ][INFO    ][30283] Running state [/srv/salt/reclass/classes/service/powerdns] at time 19:41:25.924402
2017-09-14 19:41:25,924 [salt.state       ][INFO    ][30283] Executing state file.symlink for /srv/salt/reclass/classes/service/powerdns
2017-09-14 19:41:25,925 [salt.state       ][INFO    ][30283] Symlink /srv/salt/reclass/classes/service/powerdns is present and owned by root:root
2017-09-14 19:41:25,925 [salt.state       ][INFO    ][30283] Completed state [/srv/salt/reclass/classes/service/powerdns] at time 19:41:25.925751 duration_in_ms=1.349
2017-09-14 19:41:25,926 [salt.state       ][INFO    ][30283] Running state [/srv/salt/reclass/classes/service/galera] at time 19:41:25.926282
2017-09-14 19:41:25,926 [salt.state       ][INFO    ][30283] Executing state file.symlink for /srv/salt/reclass/classes/service/galera
2017-09-14 19:41:25,927 [salt.state       ][INFO    ][30283] Symlink /srv/salt/reclass/classes/service/galera is present and owned by root:root
2017-09-14 19:41:25,927 [salt.state       ][INFO    ][30283] Completed state [/srv/salt/reclass/classes/service/galera] at time 19:41:25.927395 duration_in_ms=1.112
2017-09-14 19:41:25,927 [salt.state       ][INFO    ][30283] Running state [/srv/salt/reclass/classes/service/telegraf] at time 19:41:25.927944
2017-09-14 19:41:25,928 [salt.state       ][INFO    ][30283] Executing state file.symlink for /srv/salt/reclass/classes/service/telegraf
2017-09-14 19:41:25,928 [salt.state       ][INFO    ][30283] Symlink /srv/salt/reclass/classes/service/telegraf is present and owned by root:root
2017-09-14 19:41:25,929 [salt.state       ][INFO    ][30283] Completed state [/srv/salt/reclass/classes/service/telegraf] at time 19:41:25.929091 duration_in_ms=1.147
2017-09-14 19:41:25,929 [salt.state       ][INFO    ][30283] Running state [/srv/salt/reclass/classes/service/supervisor] at time 19:41:25.929626
2017-09-14 19:41:25,929 [salt.state       ][INFO    ][30283] Executing state file.symlink for /srv/salt/reclass/classes/service/supervisor
2017-09-14 19:41:25,930 [salt.state       ][INFO    ][30283] Symlink /srv/salt/reclass/classes/service/supervisor is present and owned by root:root
2017-09-14 19:41:25,930 [salt.state       ][INFO    ][30283] Completed state [/srv/salt/reclass/classes/service/supervisor] at time 19:41:25.930763 duration_in_ms=1.137
2017-09-14 19:41:25,931 [salt.state       ][INFO    ][30283] Running state [/srv/salt/reclass/classes/service/sensu] at time 19:41:25.931301
2017-09-14 19:41:25,931 [salt.state       ][INFO    ][30283] Executing state file.symlink for /srv/salt/reclass/classes/service/sensu
2017-09-14 19:41:25,932 [salt.state       ][INFO    ][30283] Symlink /srv/salt/reclass/classes/service/sensu is present and owned by root:root
2017-09-14 19:41:25,932 [salt.state       ][INFO    ][30283] Completed state [/srv/salt/reclass/classes/service/sensu] at time 19:41:25.932449 duration_in_ms=1.149
2017-09-14 19:41:25,933 [salt.state       ][INFO    ][30283] Running state [/srv/salt/reclass/classes/service/keepalived] at time 19:41:25.933010
2017-09-14 19:41:25,933 [salt.state       ][INFO    ][30283] Executing state file.symlink for /srv/salt/reclass/classes/service/keepalived
2017-09-14 19:41:25,934 [salt.state       ][INFO    ][30283] Symlink /srv/salt/reclass/classes/service/keepalived is present and owned by root:root
2017-09-14 19:41:25,934 [salt.state       ][INFO    ][30283] Completed state [/srv/salt/reclass/classes/service/keepalived] at time 19:41:25.934161 duration_in_ms=1.152
2017-09-14 19:41:25,934 [salt.state       ][INFO    ][30283] Running state [/srv/salt/reclass/classes/service/zookeeper] at time 19:41:25.934711
2017-09-14 19:41:25,934 [salt.state       ][INFO    ][30283] Executing state file.symlink for /srv/salt/reclass/classes/service/zookeeper
2017-09-14 19:41:25,935 [salt.state       ][INFO    ][30283] Symlink /srv/salt/reclass/classes/service/zookeeper is present and owned by root:root
2017-09-14 19:41:25,935 [salt.state       ][INFO    ][30283] Completed state [/srv/salt/reclass/classes/service/zookeeper] at time 19:41:25.935835 duration_in_ms=1.124
2017-09-14 19:41:25,936 [salt.state       ][INFO    ][30283] Running state [/srv/salt/reclass/classes/service/collectd] at time 19:41:25.936369
2017-09-14 19:41:25,936 [salt.state       ][INFO    ][30283] Executing state file.symlink for /srv/salt/reclass/classes/service/collectd
2017-09-14 19:41:25,937 [salt.state       ][INFO    ][30283] Symlink /srv/salt/reclass/classes/service/collectd is present and owned by root:root
2017-09-14 19:41:25,937 [salt.state       ][INFO    ][30283] Completed state [/srv/salt/reclass/classes/service/collectd] at time 19:41:25.937508 duration_in_ms=1.138
2017-09-14 19:41:25,938 [salt.state       ][INFO    ][30283] Running state [/srv/salt/reclass/classes/service/nagios] at time 19:41:25.938056
2017-09-14 19:41:25,938 [salt.state       ][INFO    ][30283] Executing state file.symlink for /srv/salt/reclass/classes/service/nagios
2017-09-14 19:41:25,939 [salt.state       ][INFO    ][30283] Symlink /srv/salt/reclass/classes/service/nagios is present and owned by root:root
2017-09-14 19:41:25,939 [salt.state       ][INFO    ][30283] Completed state [/srv/salt/reclass/classes/service/nagios] at time 19:41:25.939183 duration_in_ms=1.127
2017-09-14 19:41:25,939 [salt.state       ][INFO    ][30283] Running state [/srv/salt/reclass/classes/service/ceph] at time 19:41:25.939730
2017-09-14 19:41:25,939 [salt.state       ][INFO    ][30283] Executing state file.symlink for /srv/salt/reclass/classes/service/ceph
2017-09-14 19:41:25,940 [salt.state       ][INFO    ][30283] Symlink /srv/salt/reclass/classes/service/ceph is present and owned by root:root
2017-09-14 19:41:25,940 [salt.state       ][INFO    ][30283] Completed state [/srv/salt/reclass/classes/service/ceph] at time 19:41:25.940852 duration_in_ms=1.122
2017-09-14 19:41:25,941 [salt.state       ][INFO    ][30283] Running state [/srv/salt/reclass/classes/service/glusterfs] at time 19:41:25.941404
2017-09-14 19:41:25,941 [salt.state       ][INFO    ][30283] Executing state file.symlink for /srv/salt/reclass/classes/service/glusterfs
2017-09-14 19:41:25,942 [salt.state       ][INFO    ][30283] Symlink /srv/salt/reclass/classes/service/glusterfs is present and owned by root:root
2017-09-14 19:41:25,942 [salt.state       ][INFO    ][30283] Completed state [/srv/salt/reclass/classes/service/glusterfs] at time 19:41:25.942540 duration_in_ms=1.136
2017-09-14 19:41:25,943 [salt.state       ][INFO    ][30283] Running state [/srv/salt/reclass/classes/service/xtrabackup] at time 19:41:25.943086
2017-09-14 19:41:25,943 [salt.state       ][INFO    ][30283] Executing state file.symlink for /srv/salt/reclass/classes/service/xtrabackup
2017-09-14 19:41:25,944 [salt.state       ][INFO    ][30283] Symlink /srv/salt/reclass/classes/service/xtrabackup is present and owned by root:root
2017-09-14 19:41:25,944 [salt.state       ][INFO    ][30283] Completed state [/srv/salt/reclass/classes/service/xtrabackup] at time 19:41:25.944199 duration_in_ms=1.113
2017-09-14 19:41:25,944 [salt.state       ][INFO    ][30283] Running state [/srv/salt/reclass/classes/service/sahara] at time 19:41:25.944743
2017-09-14 19:41:25,944 [salt.state       ][INFO    ][30283] Executing state file.symlink for /srv/salt/reclass/classes/service/sahara
2017-09-14 19:41:25,945 [salt.state       ][INFO    ][30283] Symlink /srv/salt/reclass/classes/service/sahara is present and owned by root:root
2017-09-14 19:41:25,945 [salt.state       ][INFO    ][30283] Completed state [/srv/salt/reclass/classes/service/sahara] at time 19:41:25.945892 duration_in_ms=1.149
2017-09-14 19:41:25,946 [salt.state       ][INFO    ][30283] Running state [/srv/salt/reclass/classes/service/backupninja] at time 19:41:25.946426
2017-09-14 19:41:25,946 [salt.state       ][INFO    ][30283] Executing state file.symlink for /srv/salt/reclass/classes/service/backupninja
2017-09-14 19:41:25,947 [salt.state       ][INFO    ][30283] Symlink /srv/salt/reclass/classes/service/backupninja is present and owned by root:root
2017-09-14 19:41:25,947 [salt.state       ][INFO    ][30283] Completed state [/srv/salt/reclass/classes/service/backupninja] at time 19:41:25.947523 duration_in_ms=1.097
2017-09-14 19:41:25,948 [salt.state       ][INFO    ][30283] Running state [/srv/salt/reclass/classes/service/rsyslog] at time 19:41:25.948070
2017-09-14 19:41:25,948 [salt.state       ][INFO    ][30283] Executing state file.symlink for /srv/salt/reclass/classes/service/rsyslog
2017-09-14 19:41:25,949 [salt.state       ][INFO    ][30283] Symlink /srv/salt/reclass/classes/service/rsyslog is present and owned by root:root
2017-09-14 19:41:25,949 [salt.state       ][INFO    ][30283] Completed state [/srv/salt/reclass/classes/service/rsyslog] at time 19:41:25.949220 duration_in_ms=1.151
2017-09-14 19:41:25,949 [salt.state       ][INFO    ][30283] Running state [/srv/salt/reclass/classes/service/mysql] at time 19:41:25.949767
2017-09-14 19:41:25,949 [salt.state       ][INFO    ][30283] Executing state file.symlink for /srv/salt/reclass/classes/service/mysql
2017-09-14 19:41:25,950 [salt.state       ][INFO    ][30283] Symlink /srv/salt/reclass/classes/service/mysql is present and owned by root:root
2017-09-14 19:41:25,950 [salt.state       ][INFO    ][30283] Completed state [/srv/salt/reclass/classes/service/mysql] at time 19:41:25.950888 duration_in_ms=1.121
2017-09-14 19:41:25,951 [salt.state       ][INFO    ][30283] Running state [/srv/salt/reclass/classes/service/helm] at time 19:41:25.951435
2017-09-14 19:41:25,951 [salt.state       ][INFO    ][30283] Executing state file.symlink for /srv/salt/reclass/classes/service/helm
2017-09-14 19:41:25,952 [salt.state       ][INFO    ][30283] Symlink /srv/salt/reclass/classes/service/helm is present and owned by root:root
2017-09-14 19:41:25,952 [salt.state       ][INFO    ][30283] Completed state [/srv/salt/reclass/classes/service/helm] at time 19:41:25.952562 duration_in_ms=1.128
2017-09-14 19:41:25,953 [salt.state       ][INFO    ][30283] Running state [/srv/salt/reclass/classes/service/freeipa] at time 19:41:25.953132
2017-09-14 19:41:25,953 [salt.state       ][INFO    ][30283] Executing state file.symlink for /srv/salt/reclass/classes/service/freeipa
2017-09-14 19:41:25,954 [salt.state       ][INFO    ][30283] Symlink /srv/salt/reclass/classes/service/freeipa is present and owned by root:root
2017-09-14 19:41:25,954 [salt.state       ][INFO    ][30283] Completed state [/srv/salt/reclass/classes/service/freeipa] at time 19:41:25.954244 duration_in_ms=1.112
2017-09-14 19:41:25,954 [salt.state       ][INFO    ][30283] Running state [/srv/salt/reclass/classes/service/glance] at time 19:41:25.954792
2017-09-14 19:41:25,954 [salt.state       ][INFO    ][30283] Executing state file.symlink for /srv/salt/reclass/classes/service/glance
2017-09-14 19:41:25,955 [salt.state       ][INFO    ][30283] Symlink /srv/salt/reclass/classes/service/glance is present and owned by root:root
2017-09-14 19:41:25,955 [salt.state       ][INFO    ][30283] Completed state [/srv/salt/reclass/classes/service/glance] at time 19:41:25.955928 duration_in_ms=1.136
2017-09-14 19:41:25,956 [salt.state       ][INFO    ][30283] Running state [/srv/salt/reclass/classes/service/rundeck] at time 19:41:25.956461
2017-09-14 19:41:25,956 [salt.state       ][INFO    ][30283] Executing state file.symlink for /srv/salt/reclass/classes/service/rundeck
2017-09-14 19:41:25,957 [salt.state       ][INFO    ][30283] Symlink /srv/salt/reclass/classes/service/rundeck is present and owned by root:root
2017-09-14 19:41:25,957 [salt.state       ][INFO    ][30283] Completed state [/srv/salt/reclass/classes/service/rundeck] at time 19:41:25.957567 duration_in_ms=1.105
2017-09-14 19:41:25,958 [salt.state       ][INFO    ][30283] Running state [/srv/salt/reclass/classes/service/aptly] at time 19:41:25.958110
2017-09-14 19:41:25,958 [salt.state       ][INFO    ][30283] Executing state file.symlink for /srv/salt/reclass/classes/service/aptly
2017-09-14 19:41:25,959 [salt.state       ][INFO    ][30283] Symlink /srv/salt/reclass/classes/service/aptly is present and owned by root:root
2017-09-14 19:41:25,959 [salt.state       ][INFO    ][30283] Completed state [/srv/salt/reclass/classes/service/aptly] at time 19:41:25.959224 duration_in_ms=1.114
2017-09-14 19:41:25,959 [salt.state       ][INFO    ][30283] Running state [/srv/salt/reclass/classes/service/cassandra] at time 19:41:25.959773
2017-09-14 19:41:25,959 [salt.state       ][INFO    ][30283] Executing state file.symlink for /srv/salt/reclass/classes/service/cassandra
2017-09-14 19:41:25,960 [salt.state       ][INFO    ][30283] Symlink /srv/salt/reclass/classes/service/cassandra is present and owned by root:root
2017-09-14 19:41:25,960 [salt.state       ][INFO    ][30283] Completed state [/srv/salt/reclass/classes/service/cassandra] at time 19:41:25.960910 duration_in_ms=1.137
2017-09-14 19:41:25,961 [salt.state       ][INFO    ][30283] Running state [/srv/salt/reclass/classes/service/lldp] at time 19:41:25.961449
2017-09-14 19:41:25,961 [salt.state       ][INFO    ][30283] Executing state file.symlink for /srv/salt/reclass/classes/service/lldp
2017-09-14 19:41:25,962 [salt.state       ][INFO    ][30283] Symlink /srv/salt/reclass/classes/service/lldp is present and owned by root:root
2017-09-14 19:41:25,962 [salt.state       ][INFO    ][30283] Completed state [/srv/salt/reclass/classes/service/lldp] at time 19:41:25.962558 duration_in_ms=1.11
2017-09-14 19:41:25,963 [salt.state       ][INFO    ][30283] Running state [/srv/salt/reclass/classes/service/sphinx] at time 19:41:25.963128
2017-09-14 19:41:25,963 [salt.state       ][INFO    ][30283] Executing state file.symlink for /srv/salt/reclass/classes/service/sphinx
2017-09-14 19:41:25,964 [salt.state       ][INFO    ][30283] Symlink /srv/salt/reclass/classes/service/sphinx is present and owned by root:root
2017-09-14 19:41:25,964 [salt.state       ][INFO    ][30283] Completed state [/srv/salt/reclass/classes/service/sphinx] at time 19:41:25.964243 duration_in_ms=1.114
2017-09-14 19:41:25,964 [salt.state       ][INFO    ][30283] Running state [/srv/salt/reclass/classes/service/git] at time 19:41:25.964796
2017-09-14 19:41:25,964 [salt.state       ][INFO    ][30283] Executing state file.symlink for /srv/salt/reclass/classes/service/git
2017-09-14 19:41:25,965 [salt.state       ][INFO    ][30283] Symlink /srv/salt/reclass/classes/service/git is present and owned by root:root
2017-09-14 19:41:25,965 [salt.state       ][INFO    ][30283] Completed state [/srv/salt/reclass/classes/service/git] at time 19:41:25.965939 duration_in_ms=1.143
2017-09-14 19:41:25,966 [salt.state       ][INFO    ][30283] Running state [/srv/salt/reclass/classes/service/java] at time 19:41:25.966471
2017-09-14 19:41:25,966 [salt.state       ][INFO    ][30283] Executing state file.symlink for /srv/salt/reclass/classes/service/java
2017-09-14 19:41:25,967 [salt.state       ][INFO    ][30283] Symlink /srv/salt/reclass/classes/service/java is present and owned by root:root
2017-09-14 19:41:25,967 [salt.state       ][INFO    ][30283] Completed state [/srv/salt/reclass/classes/service/java] at time 19:41:25.967582 duration_in_ms=1.111
2017-09-14 19:41:25,968 [salt.state       ][INFO    ][30283] Running state [/srv/salt/reclass/classes/service/reclass] at time 19:41:25.968127
2017-09-14 19:41:25,968 [salt.state       ][INFO    ][30283] Executing state file.symlink for /srv/salt/reclass/classes/service/reclass
2017-09-14 19:41:25,969 [salt.state       ][INFO    ][30283] Symlink /srv/salt/reclass/classes/service/reclass is present and owned by root:root
2017-09-14 19:41:25,969 [salt.state       ][INFO    ][30283] Completed state [/srv/salt/reclass/classes/service/reclass] at time 19:41:25.969287 duration_in_ms=1.16
2017-09-14 19:41:25,969 [salt.state       ][INFO    ][30283] Running state [/srv/salt/reclass/classes/service/aodh] at time 19:41:25.969834
2017-09-14 19:41:25,970 [salt.state       ][INFO    ][30283] Executing state file.symlink for /srv/salt/reclass/classes/service/aodh
2017-09-14 19:41:25,970 [salt.state       ][INFO    ][30283] Symlink /srv/salt/reclass/classes/service/aodh is present and owned by root:root
2017-09-14 19:41:25,970 [salt.state       ][INFO    ][30283] Completed state [/srv/salt/reclass/classes/service/aodh] at time 19:41:25.970966 duration_in_ms=1.132
2017-09-14 19:41:25,971 [salt.state       ][INFO    ][30283] Running state [/srv/salt/reclass/classes/service/nova] at time 19:41:25.971507
2017-09-14 19:41:25,971 [salt.state       ][INFO    ][30283] Executing state file.symlink for /srv/salt/reclass/classes/service/nova
2017-09-14 19:41:25,972 [salt.state       ][INFO    ][30283] Symlink /srv/salt/reclass/classes/service/nova is present and owned by root:root
2017-09-14 19:41:25,972 [salt.state       ][INFO    ][30283] Completed state [/srv/salt/reclass/classes/service/nova] at time 19:41:25.972614 duration_in_ms=1.107
2017-09-14 19:41:25,973 [salt.state       ][INFO    ][30283] Running state [/srv/salt/reclass/classes/service/grafana] at time 19:41:25.973182
2017-09-14 19:41:25,973 [salt.state       ][INFO    ][30283] Executing state file.symlink for /srv/salt/reclass/classes/service/grafana
2017-09-14 19:41:25,974 [salt.state       ][INFO    ][30283] Symlink /srv/salt/reclass/classes/service/grafana is present and owned by root:root
2017-09-14 19:41:25,974 [salt.state       ][INFO    ][30283] Completed state [/srv/salt/reclass/classes/service/grafana] at time 19:41:25.974296 duration_in_ms=1.114
2017-09-14 19:41:25,974 [salt.state       ][INFO    ][30283] Running state [/srv/salt/reclass/classes/service/murano] at time 19:41:25.974843
2017-09-14 19:41:25,975 [salt.state       ][INFO    ][30283] Executing state file.symlink for /srv/salt/reclass/classes/service/murano
2017-09-14 19:41:25,975 [salt.state       ][INFO    ][30283] Symlink /srv/salt/reclass/classes/service/murano is present and owned by root:root
2017-09-14 19:41:25,975 [salt.state       ][INFO    ][30283] Completed state [/srv/salt/reclass/classes/service/murano] at time 19:41:25.975951 duration_in_ms=1.108
2017-09-14 19:41:25,976 [salt.state       ][INFO    ][30283] Running state [/srv/salt/reclass/classes/service/keystone] at time 19:41:25.976496
2017-09-14 19:41:25,976 [salt.state       ][INFO    ][30283] Executing state file.symlink for /srv/salt/reclass/classes/service/keystone
2017-09-14 19:41:25,977 [salt.state       ][INFO    ][30283] Symlink /srv/salt/reclass/classes/service/keystone is present and owned by root:root
2017-09-14 19:41:25,977 [salt.state       ][INFO    ][30283] Completed state [/srv/salt/reclass/classes/service/keystone] at time 19:41:25.977622 duration_in_ms=1.126
2017-09-14 19:41:25,978 [salt.state       ][INFO    ][30283] Running state [/srv/salt/reclass/classes/service/etcd] at time 19:41:25.978171
2017-09-14 19:41:25,978 [salt.state       ][INFO    ][30283] Executing state file.symlink for /srv/salt/reclass/classes/service/etcd
2017-09-14 19:41:25,979 [salt.state       ][INFO    ][30283] Symlink /srv/salt/reclass/classes/service/etcd is present and owned by root:root
2017-09-14 19:41:25,979 [salt.state       ][INFO    ][30283] Completed state [/srv/salt/reclass/classes/service/etcd] at time 19:41:25.979274 duration_in_ms=1.103
2017-09-14 19:41:25,979 [salt.state       ][INFO    ][30283] Running state [/srv/salt/reclass/classes/service/mongodb] at time 19:41:25.979817
2017-09-14 19:41:25,979 [salt.state       ][INFO    ][30283] Executing state file.symlink for /srv/salt/reclass/classes/service/mongodb
2017-09-14 19:41:25,980 [salt.state       ][INFO    ][30283] Symlink /srv/salt/reclass/classes/service/mongodb is present and owned by root:root
2017-09-14 19:41:25,980 [salt.state       ][INFO    ][30283] Completed state [/srv/salt/reclass/classes/service/mongodb] at time 19:41:25.980962 duration_in_ms=1.144
2017-09-14 19:41:25,981 [salt.state       ][INFO    ][30283] Running state [/srv/salt/reclass/classes/service/jenkins] at time 19:41:25.981500
2017-09-14 19:41:25,981 [salt.state       ][INFO    ][30283] Executing state file.symlink for /srv/salt/reclass/classes/service/jenkins
2017-09-14 19:41:25,982 [salt.state       ][INFO    ][30283] Symlink /srv/salt/reclass/classes/service/jenkins is present and owned by root:root
2017-09-14 19:41:25,982 [salt.state       ][INFO    ][30283] Completed state [/srv/salt/reclass/classes/service/jenkins] at time 19:41:25.982605 duration_in_ms=1.105
2017-09-14 19:41:25,983 [salt.state       ][INFO    ][30283] Running state [/srv/salt/reclass/classes/service/ccp] at time 19:41:25.983151
2017-09-14 19:41:25,983 [salt.state       ][INFO    ][30283] Executing state file.symlink for /srv/salt/reclass/classes/service/ccp
2017-09-14 19:41:25,984 [salt.state       ][INFO    ][30283] Symlink /srv/salt/reclass/classes/service/ccp is present and owned by root:root
2017-09-14 19:41:25,984 [salt.state       ][INFO    ][30283] Completed state [/srv/salt/reclass/classes/service/ccp] at time 19:41:25.984258 duration_in_ms=1.107
2017-09-14 19:41:25,984 [salt.state       ][INFO    ][30283] Running state [/srv/salt/reclass/classes/service/memcached] at time 19:41:25.984803
2017-09-14 19:41:25,985 [salt.state       ][INFO    ][30283] Executing state file.symlink for /srv/salt/reclass/classes/service/memcached
2017-09-14 19:41:25,985 [salt.state       ][INFO    ][30283] Symlink /srv/salt/reclass/classes/service/memcached is present and owned by root:root
2017-09-14 19:41:25,985 [salt.state       ][INFO    ][30283] Completed state [/srv/salt/reclass/classes/service/memcached] at time 19:41:25.985956 duration_in_ms=1.153
2017-09-14 19:41:25,986 [salt.state       ][INFO    ][30283] Running state [/srv/salt/reclass/classes/service/haproxy] at time 19:41:25.986494
2017-09-14 19:41:25,986 [salt.state       ][INFO    ][30283] Executing state file.symlink for /srv/salt/reclass/classes/service/haproxy
2017-09-14 19:41:25,987 [salt.state       ][INFO    ][30283] Symlink /srv/salt/reclass/classes/service/haproxy is present and owned by root:root
2017-09-14 19:41:25,987 [salt.state       ][INFO    ][30283] Completed state [/srv/salt/reclass/classes/service/haproxy] at time 19:41:25.987603 duration_in_ms=1.108
2017-09-14 19:41:25,988 [salt.state       ][INFO    ][30283] Running state [/srv/salt/reclass/classes/service/neutron] at time 19:41:25.988162
2017-09-14 19:41:25,988 [salt.state       ][INFO    ][30283] Executing state file.symlink for /srv/salt/reclass/classes/service/neutron
2017-09-14 19:41:25,989 [salt.state       ][INFO    ][30283] Symlink /srv/salt/reclass/classes/service/neutron is present and owned by root:root
2017-09-14 19:41:25,989 [salt.state       ][INFO    ][30283] Completed state [/srv/salt/reclass/classes/service/neutron] at time 19:41:25.989311 duration_in_ms=1.148
2017-09-14 19:41:25,989 [salt.state       ][INFO    ][30283] Running state [/srv/salt/reclass/classes/service/designate] at time 19:41:25.989856
2017-09-14 19:41:25,990 [salt.state       ][INFO    ][30283] Executing state file.symlink for /srv/salt/reclass/classes/service/designate
2017-09-14 19:41:25,990 [salt.state       ][INFO    ][30283] Symlink /srv/salt/reclass/classes/service/designate is present and owned by root:root
2017-09-14 19:41:25,990 [salt.state       ][INFO    ][30283] Completed state [/srv/salt/reclass/classes/service/designate] at time 19:41:25.990972 duration_in_ms=1.116
2017-09-14 19:41:25,991 [salt.state       ][INFO    ][30283] Running state [/srv/salt/reclass/classes/service/iptables] at time 19:41:25.991508
2017-09-14 19:41:25,991 [salt.state       ][INFO    ][30283] Executing state file.symlink for /srv/salt/reclass/classes/service/iptables
2017-09-14 19:41:25,992 [salt.state       ][INFO    ][30283] Symlink /srv/salt/reclass/classes/service/iptables is present and owned by root:root
2017-09-14 19:41:25,992 [salt.state       ][INFO    ][30283] Completed state [/srv/salt/reclass/classes/service/iptables] at time 19:41:25.992643 duration_in_ms=1.134
2017-09-14 19:41:25,993 [salt.state       ][INFO    ][30283] Running state [/srv/salt/reclass/classes/service/statsd] at time 19:41:25.993212
2017-09-14 19:41:25,993 [salt.state       ][INFO    ][30283] Executing state file.symlink for /srv/salt/reclass/classes/service/statsd
2017-09-14 19:41:25,994 [salt.state       ][INFO    ][30283] Symlink /srv/salt/reclass/classes/service/statsd is present and owned by root:root
2017-09-14 19:41:25,994 [salt.state       ][INFO    ][30283] Completed state [/srv/salt/reclass/classes/service/statsd] at time 19:41:25.994333 duration_in_ms=1.121
2017-09-14 19:41:25,994 [salt.state       ][INFO    ][30283] Running state [/srv/salt/reclass/classes/service/kibana] at time 19:41:25.994884
2017-09-14 19:41:25,995 [salt.state       ][INFO    ][30283] Executing state file.symlink for /srv/salt/reclass/classes/service/kibana
2017-09-14 19:41:25,995 [salt.state       ][INFO    ][30283] Symlink /srv/salt/reclass/classes/service/kibana is present and owned by root:root
2017-09-14 19:41:25,996 [salt.state       ][INFO    ][30283] Completed state [/srv/salt/reclass/classes/service/kibana] at time 19:41:25.995995 duration_in_ms=1.111
2017-09-14 19:41:25,996 [salt.state       ][INFO    ][30283] Running state [/srv/salt/reclass/classes/service/kubernetes] at time 19:41:25.996531
2017-09-14 19:41:25,996 [salt.state       ][INFO    ][30283] Executing state file.symlink for /srv/salt/reclass/classes/service/kubernetes
2017-09-14 19:41:25,997 [salt.state       ][INFO    ][30283] Symlink /srv/salt/reclass/classes/service/kubernetes is present and owned by root:root
2017-09-14 19:41:25,997 [salt.state       ][INFO    ][30283] Completed state [/srv/salt/reclass/classes/service/kubernetes] at time 19:41:25.997642 duration_in_ms=1.111
2017-09-14 19:41:25,998 [salt.state       ][INFO    ][30283] Running state [/srv/salt/reclass/classes/service/python] at time 19:41:25.998192
2017-09-14 19:41:25,998 [salt.state       ][INFO    ][30283] Executing state file.symlink for /srv/salt/reclass/classes/service/python
2017-09-14 19:41:25,999 [salt.state       ][INFO    ][30283] Symlink /srv/salt/reclass/classes/service/python is present and owned by root:root
2017-09-14 19:41:25,999 [salt.state       ][INFO    ][30283] Completed state [/srv/salt/reclass/classes/service/python] at time 19:41:25.999292 duration_in_ms=1.099
2017-09-14 19:41:25,999 [salt.state       ][INFO    ][30283] Running state [/srv/salt/reclass/classes/service/ntp] at time 19:41:25.999852
2017-09-14 19:41:26,000 [salt.state       ][INFO    ][30283] Executing state file.symlink for /srv/salt/reclass/classes/service/ntp
2017-09-14 19:41:26,000 [salt.state       ][INFO    ][30283] Symlink /srv/salt/reclass/classes/service/ntp is present and owned by root:root
2017-09-14 19:41:26,001 [salt.state       ][INFO    ][30283] Completed state [/srv/salt/reclass/classes/service/ntp] at time 19:41:26.000988 duration_in_ms=1.137
2017-09-14 19:41:26,001 [salt.state       ][INFO    ][30283] Running state [/srv/salt/reclass/classes/service/devops_portal] at time 19:41:26.001535
2017-09-14 19:41:26,001 [salt.state       ][INFO    ][30283] Executing state file.symlink for /srv/salt/reclass/classes/service/devops_portal
2017-09-14 19:41:26,002 [salt.state       ][INFO    ][30283] Symlink /srv/salt/reclass/classes/service/devops_portal is present and owned by root:root
2017-09-14 19:41:26,002 [salt.state       ][INFO    ][30283] Completed state [/srv/salt/reclass/classes/service/devops_portal] at time 19:41:26.002696 duration_in_ms=1.161
2017-09-14 19:41:26,003 [salt.state       ][INFO    ][30283] Running state [/srv/salt/reclass/classes/service/maas] at time 19:41:26.003240
2017-09-14 19:41:26,003 [salt.state       ][INFO    ][30283] Executing state file.symlink for /srv/salt/reclass/classes/service/maas
2017-09-14 19:41:26,004 [salt.state       ][INFO    ][30283] Symlink /srv/salt/reclass/classes/service/maas is present and owned by root:root
2017-09-14 19:41:26,004 [salt.state       ][INFO    ][30283] Completed state [/srv/salt/reclass/classes/service/maas] at time 19:41:26.004362 duration_in_ms=1.121
2017-09-14 19:41:26,004 [salt.state       ][INFO    ][30283] Running state [/srv/salt/reclass/classes/service/libvirt] at time 19:41:26.004930
2017-09-14 19:41:26,005 [salt.state       ][INFO    ][30283] Executing state file.symlink for /srv/salt/reclass/classes/service/libvirt
2017-09-14 19:41:26,005 [salt.state       ][INFO    ][30283] Symlink /srv/salt/reclass/classes/service/libvirt is present and owned by root:root
2017-09-14 19:41:26,006 [salt.state       ][INFO    ][30283] Completed state [/srv/salt/reclass/classes/service/libvirt] at time 19:41:26.006047 duration_in_ms=1.117
2017-09-14 19:41:26,006 [salt.state       ][INFO    ][30283] Running state [/srv/salt/reclass/classes/service/heka] at time 19:41:26.006584
2017-09-14 19:41:26,006 [salt.state       ][INFO    ][30283] Executing state file.symlink for /srv/salt/reclass/classes/service/heka
2017-09-14 19:41:26,007 [salt.state       ][INFO    ][30283] Symlink /srv/salt/reclass/classes/service/heka is present and owned by root:root
2017-09-14 19:41:26,007 [salt.state       ][INFO    ][30283] Completed state [/srv/salt/reclass/classes/service/heka] at time 19:41:26.007719 duration_in_ms=1.134
2017-09-14 19:41:26,008 [salt.state       ][INFO    ][30283] Running state [/srv/salt/reclass/classes/service/heat] at time 19:41:26.008261
2017-09-14 19:41:26,008 [salt.state       ][INFO    ][30283] Executing state file.symlink for /srv/salt/reclass/classes/service/heat
2017-09-14 19:41:26,009 [salt.state       ][INFO    ][30283] Symlink /srv/salt/reclass/classes/service/heat is present and owned by root:root
2017-09-14 19:41:26,009 [salt.state       ][INFO    ][30283] Completed state [/srv/salt/reclass/classes/service/heat] at time 19:41:26.009419 duration_in_ms=1.157
2017-09-14 19:41:26,009 [salt.state       ][INFO    ][30283] Running state [/srv/salt/reclass/classes/service/openldap] at time 19:41:26.009962
2017-09-14 19:41:26,010 [salt.state       ][INFO    ][30283] Executing state file.symlink for /srv/salt/reclass/classes/service/openldap
2017-09-14 19:41:26,010 [salt.state       ][INFO    ][30283] Symlink /srv/salt/reclass/classes/service/openldap is present and owned by root:root
2017-09-14 19:41:26,011 [salt.state       ][INFO    ][30283] Completed state [/srv/salt/reclass/classes/service/openldap] at time 19:41:26.011078 duration_in_ms=1.116
2017-09-14 19:41:26,011 [salt.state       ][INFO    ][30283] Running state [/srv/salt/reclass/classes/service/influxdb] at time 19:41:26.011632
2017-09-14 19:41:26,011 [salt.state       ][INFO    ][30283] Executing state file.symlink for /srv/salt/reclass/classes/service/influxdb
2017-09-14 19:41:26,012 [salt.state       ][INFO    ][30283] Symlink /srv/salt/reclass/classes/service/influxdb is present and owned by root:root
2017-09-14 19:41:26,012 [salt.state       ][INFO    ][30283] Completed state [/srv/salt/reclass/classes/service/influxdb] at time 19:41:26.012760 duration_in_ms=1.128
2017-09-14 19:41:26,013 [salt.state       ][INFO    ][30283] Running state [/srv/salt/reclass/classes/service/apache] at time 19:41:26.013345
2017-09-14 19:41:26,013 [salt.state       ][INFO    ][30283] Executing state file.symlink for /srv/salt/reclass/classes/service/apache
2017-09-14 19:41:26,014 [salt.state       ][INFO    ][30283] Symlink /srv/salt/reclass/classes/service/apache is present and owned by root:root
2017-09-14 19:41:26,014 [salt.state       ][INFO    ][30283] Completed state [/srv/salt/reclass/classes/service/apache] at time 19:41:26.014457 duration_in_ms=1.113
2017-09-14 19:41:26,015 [salt.state       ][INFO    ][30283] Running state [/srv/salt/reclass/classes/service/postgresql] at time 19:41:26.015007
2017-09-14 19:41:26,015 [salt.state       ][INFO    ][30283] Executing state file.symlink for /srv/salt/reclass/classes/service/postgresql
2017-09-14 19:41:26,016 [salt.state       ][INFO    ][30283] Symlink /srv/salt/reclass/classes/service/postgresql is present and owned by root:root
2017-09-14 19:41:26,016 [salt.state       ][INFO    ][30283] Completed state [/srv/salt/reclass/classes/service/postgresql] at time 19:41:26.016114 duration_in_ms=1.106
2017-09-14 19:41:26,016 [salt.state       ][INFO    ][30283] Running state [/srv/salt/reclass/classes/service/swift] at time 19:41:26.016653
2017-09-14 19:41:26,016 [salt.state       ][INFO    ][30283] Executing state file.symlink for /srv/salt/reclass/classes/service/swift
2017-09-14 19:41:26,017 [salt.state       ][INFO    ][30283] Symlink /srv/salt/reclass/classes/service/swift is present and owned by root:root
2017-09-14 19:41:26,017 [salt.state       ][INFO    ][30283] Completed state [/srv/salt/reclass/classes/service/swift] at time 19:41:26.017870 duration_in_ms=1.218
2017-09-14 19:41:26,018 [salt.state       ][INFO    ][30283] Running state [/srv/salt/reclass/classes/service/billometer] at time 19:41:26.018411
2017-09-14 19:41:26,018 [salt.state       ][INFO    ][30283] Executing state file.symlink for /srv/salt/reclass/classes/service/billometer
2017-09-14 19:41:26,019 [salt.state       ][INFO    ][30283] Symlink /srv/salt/reclass/classes/service/billometer is present and owned by root:root
2017-09-14 19:41:26,019 [salt.state       ][INFO    ][30283] Completed state [/srv/salt/reclass/classes/service/billometer] at time 19:41:26.019514 duration_in_ms=1.103
2017-09-14 19:41:26,020 [salt.state       ][INFO    ][30283] Running state [/srv/salt/reclass/classes/service/linux] at time 19:41:26.020062
2017-09-14 19:41:26,020 [salt.state       ][INFO    ][30283] Executing state file.symlink for /srv/salt/reclass/classes/service/linux
2017-09-14 19:41:26,021 [salt.state       ][INFO    ][30283] Symlink /srv/salt/reclass/classes/service/linux is present and owned by root:root
2017-09-14 19:41:26,021 [salt.state       ][INFO    ][30283] Completed state [/srv/salt/reclass/classes/service/linux] at time 19:41:26.021198 duration_in_ms=1.136
2017-09-14 19:41:26,021 [salt.state       ][INFO    ][30283] Running state [/srv/salt/reclass/classes/service/ceilometer] at time 19:41:26.021741
2017-09-14 19:41:26,021 [salt.state       ][INFO    ][30283] Executing state file.symlink for /srv/salt/reclass/classes/service/ceilometer
2017-09-14 19:41:26,022 [salt.state       ][INFO    ][30283] Symlink /srv/salt/reclass/classes/service/ceilometer is present and owned by root:root
2017-09-14 19:41:26,022 [salt.state       ][INFO    ][30283] Completed state [/srv/salt/reclass/classes/service/ceilometer] at time 19:41:26.022847 duration_in_ms=1.106
2017-09-14 19:41:26,023 [salt.state       ][INFO    ][30283] Running state [/srv/salt/reclass/classes/service/aptcacher] at time 19:41:26.023385
2017-09-14 19:41:26,023 [salt.state       ][INFO    ][30283] Executing state file.symlink for /srv/salt/reclass/classes/service/aptcacher
2017-09-14 19:41:26,024 [salt.state       ][INFO    ][30283] Symlink /srv/salt/reclass/classes/service/aptcacher is present and owned by root:root
2017-09-14 19:41:26,024 [salt.state       ][INFO    ][30283] Completed state [/srv/salt/reclass/classes/service/aptcacher] at time 19:41:26.024494 duration_in_ms=1.109
2017-09-14 19:41:26,025 [salt.state       ][INFO    ][30283] Running state [/srv/salt/reclass/classes/service/nginx] at time 19:41:26.025060
2017-09-14 19:41:26,025 [salt.state       ][INFO    ][30283] Executing state file.symlink for /srv/salt/reclass/classes/service/nginx
2017-09-14 19:41:26,026 [salt.state       ][INFO    ][30283] Symlink /srv/salt/reclass/classes/service/nginx is present and owned by root:root
2017-09-14 19:41:26,026 [salt.state       ][INFO    ][30283] Completed state [/srv/salt/reclass/classes/service/nginx] at time 19:41:26.026173 duration_in_ms=1.113
2017-09-14 19:41:26,026 [salt.state       ][INFO    ][30283] Running state [/srv/salt/reclass/classes/service/bind] at time 19:41:26.026715
2017-09-14 19:41:26,026 [salt.state       ][INFO    ][30283] Executing state file.symlink for /srv/salt/reclass/classes/service/bind
2017-09-14 19:41:26,027 [salt.state       ][INFO    ][30283] Symlink /srv/salt/reclass/classes/service/bind is present and owned by root:root
2017-09-14 19:41:26,027 [salt.state       ][INFO    ][30283] Completed state [/srv/salt/reclass/classes/service/bind] at time 19:41:26.027841 duration_in_ms=1.126
2017-09-14 19:41:26,028 [salt.state       ][INFO    ][30283] Running state [/srv/salt/reclass/classes/service/redis] at time 19:41:26.028379
2017-09-14 19:41:26,028 [salt.state       ][INFO    ][30283] Executing state file.symlink for /srv/salt/reclass/classes/service/redis
2017-09-14 19:41:26,029 [salt.state       ][INFO    ][30283] Symlink /srv/salt/reclass/classes/service/redis is present and owned by root:root
2017-09-14 19:41:26,029 [salt.state       ][INFO    ][30283] Completed state [/srv/salt/reclass/classes/service/redis] at time 19:41:26.029514 duration_in_ms=1.134
2017-09-14 19:41:26,030 [salt.state       ][INFO    ][30283] Running state [/srv/salt/reclass/classes/service/opencontrail] at time 19:41:26.030060
2017-09-14 19:41:26,030 [salt.state       ][INFO    ][30283] Executing state file.symlink for /srv/salt/reclass/classes/service/opencontrail
2017-09-14 19:41:26,031 [salt.state       ][INFO    ][30283] Symlink /srv/salt/reclass/classes/service/opencontrail is present and owned by root:root
2017-09-14 19:41:26,031 [salt.state       ][INFO    ][30283] Completed state [/srv/salt/reclass/classes/service/opencontrail] at time 19:41:26.031175 duration_in_ms=1.114
2017-09-14 19:41:26,031 [salt.state       ][INFO    ][30283] Running state [/srv/salt/reclass/classes/service/gerrit] at time 19:41:26.031716
2017-09-14 19:41:26,031 [salt.state       ][INFO    ][30283] Executing state file.symlink for /srv/salt/reclass/classes/service/gerrit
2017-09-14 19:41:26,032 [salt.state       ][INFO    ][30283] Symlink /srv/salt/reclass/classes/service/gerrit is present and owned by root:root
2017-09-14 19:41:26,032 [salt.state       ][INFO    ][30283] Completed state [/srv/salt/reclass/classes/service/gerrit] at time 19:41:26.032820 duration_in_ms=1.104
2017-09-14 19:41:26,033 [salt.state       ][INFO    ][30283] Running state [/srv/salt/reclass/classes/service/rabbitmq] at time 19:41:26.033376
2017-09-14 19:41:26,033 [salt.state       ][INFO    ][30283] Executing state file.symlink for /srv/salt/reclass/classes/service/rabbitmq
2017-09-14 19:41:26,034 [salt.state       ][INFO    ][30283] Symlink /srv/salt/reclass/classes/service/rabbitmq is present and owned by root:root
2017-09-14 19:41:26,034 [salt.state       ][INFO    ][30283] Completed state [/srv/salt/reclass/classes/service/rabbitmq] at time 19:41:26.034488 duration_in_ms=1.112
2017-09-14 19:41:26,035 [salt.state       ][INFO    ][30283] Running state [/srv/salt/reclass/classes/service/octavia] at time 19:41:26.035040
2017-09-14 19:41:26,035 [salt.state       ][INFO    ][30283] Executing state file.symlink for /srv/salt/reclass/classes/service/octavia
2017-09-14 19:41:26,036 [salt.state       ][INFO    ][30283] Symlink /srv/salt/reclass/classes/service/octavia is present and owned by root:root
2017-09-14 19:41:26,036 [salt.state       ][INFO    ][30283] Completed state [/srv/salt/reclass/classes/service/octavia] at time 19:41:26.036149 duration_in_ms=1.11
2017-09-14 19:41:26,036 [salt.state       ][INFO    ][30283] Running state [/srv/salt/reclass/classes/service/graphite] at time 19:41:26.036690
2017-09-14 19:41:26,036 [salt.state       ][INFO    ][30283] Executing state file.symlink for /srv/salt/reclass/classes/service/graphite
2017-09-14 19:41:26,037 [salt.state       ][INFO    ][30283] Symlink /srv/salt/reclass/classes/service/graphite is present and owned by root:root
2017-09-14 19:41:26,037 [salt.state       ][INFO    ][30283] Completed state [/srv/salt/reclass/classes/service/graphite] at time 19:41:26.037816 duration_in_ms=1.126
2017-09-14 19:41:26,038 [salt.state       ][INFO    ][30283] Running state [/srv/salt/reclass/classes/service/elasticsearch] at time 19:41:26.038349
2017-09-14 19:41:26,038 [salt.state       ][INFO    ][30283] Executing state file.symlink for /srv/salt/reclass/classes/service/elasticsearch
2017-09-14 19:41:26,039 [salt.state       ][INFO    ][30283] Symlink /srv/salt/reclass/classes/service/elasticsearch is present and owned by root:root
2017-09-14 19:41:26,039 [salt.state       ][INFO    ][30283] Completed state [/srv/salt/reclass/classes/service/elasticsearch] at time 19:41:26.039458 duration_in_ms=1.108
2017-09-14 19:41:26,040 [salt.state       ][INFO    ][30283] Running state [/srv/salt/reclass/classes/service/horizon] at time 19:41:26.040001
2017-09-14 19:41:26,040 [salt.state       ][INFO    ][30283] Executing state file.symlink for /srv/salt/reclass/classes/service/horizon
2017-09-14 19:41:26,041 [salt.state       ][INFO    ][30283] Symlink /srv/salt/reclass/classes/service/horizon is present and owned by root:root
2017-09-14 19:41:26,041 [salt.state       ][INFO    ][30283] Completed state [/srv/salt/reclass/classes/service/horizon] at time 19:41:26.041166 duration_in_ms=1.164
2017-09-14 19:41:26,041 [salt.state       ][INFO    ][30283] Running state [/srv/salt/reclass/classes/service/openssh] at time 19:41:26.041712
2017-09-14 19:41:26,041 [salt.state       ][INFO    ][30283] Executing state file.symlink for /srv/salt/reclass/classes/service/openssh
2017-09-14 19:41:26,042 [salt.state       ][INFO    ][30283] Symlink /srv/salt/reclass/classes/service/openssh is present and owned by root:root
2017-09-14 19:41:26,042 [salt.state       ][INFO    ][30283] Completed state [/srv/salt/reclass/classes/service/openssh] at time 19:41:26.042828 duration_in_ms=1.116
2017-09-14 19:41:26,043 [salt.state       ][INFO    ][30283] Running state [/srv/salt/reclass/classes/service/cinder] at time 19:41:26.043359
2017-09-14 19:41:26,043 [salt.state       ][INFO    ][30283] Executing state file.symlink for /srv/salt/reclass/classes/service/cinder
2017-09-14 19:41:26,044 [salt.state       ][INFO    ][30283] Symlink /srv/salt/reclass/classes/service/cinder is present and owned by root:root
2017-09-14 19:41:26,044 [salt.state       ][INFO    ][30283] Completed state [/srv/salt/reclass/classes/service/cinder] at time 19:41:26.044778 duration_in_ms=1.418
2017-09-14 19:41:26,045 [salt.state       ][INFO    ][30283] Running state [/srv/salt/reclass/classes/service/docker] at time 19:41:26.045359
2017-09-14 19:41:26,045 [salt.state       ][INFO    ][30283] Executing state file.symlink for /srv/salt/reclass/classes/service/docker
2017-09-14 19:41:26,046 [salt.state       ][INFO    ][30283] Symlink /srv/salt/reclass/classes/service/docker is present and owned by root:root
2017-09-14 19:41:26,046 [salt.state       ][INFO    ][30283] Completed state [/srv/salt/reclass/classes/service/docker] at time 19:41:26.046480 duration_in_ms=1.12
2017-09-14 19:41:26,047 [salt.state       ][INFO    ][30283] Running state [/srv/salt/reclass/classes/service/salt] at time 19:41:26.047021
2017-09-14 19:41:26,047 [salt.state       ][INFO    ][30283] Executing state file.symlink for /srv/salt/reclass/classes/service/salt
2017-09-14 19:41:26,048 [salt.state       ][INFO    ][30283] Symlink /srv/salt/reclass/classes/service/salt is present and owned by root:root
2017-09-14 19:41:26,048 [salt.state       ][INFO    ][30283] Completed state [/srv/salt/reclass/classes/service/salt] at time 19:41:26.048135 duration_in_ms=1.113
2017-09-14 19:41:26,048 [salt.state       ][INFO    ][30283] Running state [/srv/salt/reclass/classes/service/prometheus] at time 19:41:26.048690
2017-09-14 19:41:26,048 [salt.state       ][INFO    ][30283] Executing state file.symlink for /srv/salt/reclass/classes/service/prometheus
2017-09-14 19:41:26,049 [salt.state       ][INFO    ][30283] Symlink /srv/salt/reclass/classes/service/prometheus is present and owned by root:root
2017-09-14 19:41:26,049 [salt.state       ][INFO    ][30283] Completed state [/srv/salt/reclass/classes/service/prometheus] at time 19:41:26.049845 duration_in_ms=1.155
2017-09-14 19:41:26,050 [salt.state       ][INFO    ][30283] Running state [salt-minion] at time 19:41:26.049982
2017-09-14 19:41:26,050 [salt.state       ][INFO    ][30283] Executing state pkg.installed for salt-minion
2017-09-14 19:41:26,053 [salt.state       ][INFO    ][30283] Package salt-minion is already installed
2017-09-14 19:41:26,054 [salt.state       ][INFO    ][30283] Completed state [salt-minion] at time 19:41:26.054112 duration_in_ms=4.128
2017-09-14 19:41:26,054 [salt.state       ][INFO    ][30283] Running state [python-yaml] at time 19:41:26.054248
2017-09-14 19:41:26,054 [salt.state       ][INFO    ][30283] Executing state pkg.installed for python-yaml
2017-09-14 19:41:26,057 [salt.state       ][INFO    ][30283] Package python-yaml is already installed
2017-09-14 19:41:26,058 [salt.state       ][INFO    ][30283] Completed state [python-yaml] at time 19:41:26.058030 duration_in_ms=3.782
2017-09-14 19:41:26,058 [salt.state       ][INFO    ][30283] Running state [python-psutil] at time 19:41:26.058164
2017-09-14 19:41:26,058 [salt.state       ][INFO    ][30283] Executing state pkg.installed for python-psutil
2017-09-14 19:41:26,061 [salt.state       ][INFO    ][30283] Package python-psutil is already installed
2017-09-14 19:41:26,061 [salt.state       ][INFO    ][30283] Completed state [python-psutil] at time 19:41:26.061918 duration_in_ms=3.754
2017-09-14 19:41:26,062 [salt.state       ][INFO    ][30283] Running state [python-m2crypto] at time 19:41:26.062051
2017-09-14 19:41:26,062 [salt.state       ][INFO    ][30283] Executing state pkg.installed for python-m2crypto
2017-09-14 19:41:26,065 [salt.state       ][INFO    ][30283] Package python-m2crypto is already installed
2017-09-14 19:41:26,065 [salt.state       ][INFO    ][30283] Completed state [python-m2crypto] at time 19:41:26.065792 duration_in_ms=3.74
2017-09-14 19:41:26,066 [salt.state       ][INFO    ][30283] Running state [/etc/salt/minion.d/minion.conf] at time 19:41:26.066439
2017-09-14 19:41:26,066 [salt.state       ][INFO    ][30283] Executing state file.managed for /etc/salt/minion.d/minion.conf
2017-09-14 19:41:26,077 [salt.minion      ][INFO    ][30118] User sudo_ubuntu Executing command saltutil.find_job with jid 20170914194126060655
2017-09-14 19:41:26,102 [salt.minion      ][INFO    ][30590] Starting a new job with PID 30590
2017-09-14 19:41:26,118 [salt.minion      ][INFO    ][30590] Returning information for job: 20170914194126060655
2017-09-14 19:41:26,190 [salt.state       ][INFO    ][30283] File /etc/salt/minion.d/minion.conf is in the correct state
2017-09-14 19:41:26,191 [salt.state       ][INFO    ][30283] Completed state [/etc/salt/minion.d/minion.conf] at time 19:41:26.191123 duration_in_ms=124.682
2017-09-14 19:41:26,191 [salt.state       ][INFO    ][30283] Running state [/etc/salt/minion.d/_pki.conf] at time 19:41:26.191810
2017-09-14 19:41:26,192 [salt.state       ][INFO    ][30283] Executing state file.managed for /etc/salt/minion.d/_pki.conf
2017-09-14 19:41:26,195 [salt.state       ][INFO    ][30283] File /etc/salt/minion.d/_pki.conf is in the correct state
2017-09-14 19:41:26,195 [salt.state       ][INFO    ][30283] Completed state [/etc/salt/minion.d/_pki.conf] at time 19:41:26.195378 duration_in_ms=3.566
2017-09-14 19:41:26,199 [salt.state       ][INFO    ][30283] Running state [salt-minion] at time 19:41:26.198989
2017-09-14 19:41:26,199 [salt.state       ][INFO    ][30283] Executing state service.running for salt-minion
2017-09-14 19:41:26,200 [salt.loaded.int.module.cmdmod][INFO    ][30283] Executing command ['systemctl', 'status', 'salt-minion.service', '-n', '0'] in directory '/root'
2017-09-14 19:41:26,218 [salt.loaded.int.module.cmdmod][INFO    ][30283] Executing command ['systemctl', 'is-active', 'salt-minion.service'] in directory '/root'
2017-09-14 19:41:26,233 [salt.loaded.int.module.cmdmod][INFO    ][30283] Executing command ['systemctl', 'is-enabled', 'salt-minion.service'] in directory '/root'
2017-09-14 19:41:26,246 [salt.state       ][INFO    ][30283] The service salt-minion is already running
2017-09-14 19:41:26,247 [salt.state       ][INFO    ][30283] Completed state [salt-minion] at time 19:41:26.247144 duration_in_ms=48.155
2017-09-14 19:41:26,251 [salt.state       ][INFO    ][30283] Running state [/etc/salt/grains.d] at time 19:41:26.251371
2017-09-14 19:41:26,252 [salt.state       ][INFO    ][30283] Executing state file.directory for /etc/salt/grains.d
2017-09-14 19:41:26,253 [salt.state       ][INFO    ][30283] Directory /etc/salt/grains.d is in the correct state
2017-09-14 19:41:26,254 [salt.state       ][INFO    ][30283] Completed state [/etc/salt/grains.d] at time 19:41:26.254286 duration_in_ms=2.915
2017-09-14 19:41:26,256 [salt.state       ][INFO    ][30283] Running state [/etc/salt/grains] at time 19:41:26.256266
2017-09-14 19:41:26,257 [salt.state       ][INFO    ][30283] Executing state file.managed for /etc/salt/grains
2017-09-14 19:41:26,258 [salt.state       ][INFO    ][30283] File /etc/salt/grains exists with proper permissions. No changes made.
2017-09-14 19:41:26,258 [salt.state       ][INFO    ][30283] Completed state [/etc/salt/grains] at time 19:41:26.258563 duration_in_ms=2.298
2017-09-14 19:41:26,260 [salt.state       ][INFO    ][30283] Running state [/etc/salt/grains.d/placeholder] at time 19:41:26.260167
2017-09-14 19:41:26,260 [salt.state       ][INFO    ][30283] Executing state file.managed for /etc/salt/grains.d/placeholder
2017-09-14 19:41:26,261 [salt.state       ][INFO    ][30283] File /etc/salt/grains.d/placeholder exists with proper permissions. No changes made.
2017-09-14 19:41:26,262 [salt.state       ][INFO    ][30283] Completed state [/etc/salt/grains.d/placeholder] at time 19:41:26.262402 duration_in_ms=2.235
2017-09-14 19:41:26,264 [salt.state       ][INFO    ][30283] Running state [/etc/salt/grains.d/sphinx] at time 19:41:26.263999
2017-09-14 19:41:26,264 [salt.state       ][INFO    ][30283] Executing state file.managed for /etc/salt/grains.d/sphinx
2017-09-14 19:41:26,271 [salt.state       ][INFO    ][30283] File /etc/salt/grains.d/sphinx is in the correct state
2017-09-14 19:41:26,272 [salt.state       ][INFO    ][30283] Completed state [/etc/salt/grains.d/sphinx] at time 19:41:26.272490 duration_in_ms=8.49
2017-09-14 19:41:26,274 [salt.state       ][INFO    ][30283] Running state [python -c "import yaml; stream = file('/etc/salt/grains.d/sphinx', 'r'); yaml.load(stream); stream.close()"] at time 19:41:26.274367
2017-09-14 19:41:26,275 [salt.state       ][INFO    ][30283] Executing state cmd.wait for python -c "import yaml; stream = file('/etc/salt/grains.d/sphinx', 'r'); yaml.load(stream); stream.close()"
2017-09-14 19:41:26,275 [salt.state       ][INFO    ][30283] No changes made for python -c "import yaml; stream = file('/etc/salt/grains.d/sphinx', 'r'); yaml.load(stream); stream.close()"
2017-09-14 19:41:26,276 [salt.state       ][INFO    ][30283] Completed state [python -c "import yaml; stream = file('/etc/salt/grains.d/sphinx', 'r'); yaml.load(stream); stream.close()"] at time 19:41:26.276260 duration_in_ms=1.894
2017-09-14 19:41:26,277 [salt.state       ][INFO    ][30283] Running state [/etc/salt/grains.d/dns_records] at time 19:41:26.277812
2017-09-14 19:41:26,278 [salt.state       ][INFO    ][30283] Executing state file.managed for /etc/salt/grains.d/dns_records
2017-09-14 19:41:26,283 [salt.state       ][INFO    ][30283] File /etc/salt/grains.d/dns_records is in the correct state
2017-09-14 19:41:26,284 [salt.state       ][INFO    ][30283] Completed state [/etc/salt/grains.d/dns_records] at time 19:41:26.284490 duration_in_ms=6.677
2017-09-14 19:41:26,286 [salt.state       ][INFO    ][30283] Running state [python -c "import yaml; stream = file('/etc/salt/grains.d/dns_records', 'r'); yaml.load(stream); stream.close()"] at time 19:41:26.286403
2017-09-14 19:41:26,287 [salt.state       ][INFO    ][30283] Executing state cmd.wait for python -c "import yaml; stream = file('/etc/salt/grains.d/dns_records', 'r'); yaml.load(stream); stream.close()"
2017-09-14 19:41:26,287 [salt.state       ][INFO    ][30283] No changes made for python -c "import yaml; stream = file('/etc/salt/grains.d/dns_records', 'r'); yaml.load(stream); stream.close()"
2017-09-14 19:41:26,288 [salt.state       ][INFO    ][30283] Completed state [python -c "import yaml; stream = file('/etc/salt/grains.d/dns_records', 'r'); yaml.load(stream); stream.close()"] at time 19:41:26.288291 duration_in_ms=1.888
2017-09-14 19:41:26,289 [salt.state       ][INFO    ][30283] Running state [/etc/salt/grains.d/salt] at time 19:41:26.289839
2017-09-14 19:41:26,290 [salt.state       ][INFO    ][30283] Executing state file.managed for /etc/salt/grains.d/salt
2017-09-14 19:41:26,295 [salt.state       ][INFO    ][30283] File /etc/salt/grains.d/salt is in the correct state
2017-09-14 19:41:26,296 [salt.state       ][INFO    ][30283] Completed state [/etc/salt/grains.d/salt] at time 19:41:26.296375 duration_in_ms=6.535
2017-09-14 19:41:26,298 [salt.state       ][INFO    ][30283] Running state [python -c "import yaml; stream = file('/etc/salt/grains.d/salt', 'r'); yaml.load(stream); stream.close()"] at time 19:41:26.298133
2017-09-14 19:41:26,298 [salt.state       ][INFO    ][30283] Executing state cmd.wait for python -c "import yaml; stream = file('/etc/salt/grains.d/salt', 'r'); yaml.load(stream); stream.close()"
2017-09-14 19:41:26,299 [salt.state       ][INFO    ][30283] No changes made for python -c "import yaml; stream = file('/etc/salt/grains.d/salt', 'r'); yaml.load(stream); stream.close()"
2017-09-14 19:41:26,300 [salt.state       ][INFO    ][30283] Completed state [python -c "import yaml; stream = file('/etc/salt/grains.d/salt', 'r'); yaml.load(stream); stream.close()"] at time 19:41:26.299946 duration_in_ms=1.813
2017-09-14 19:41:26,304 [salt.state       ][INFO    ][30283] Running state [cat /etc/salt/grains.d/* > /etc/salt/grains] at time 19:41:26.304761
2017-09-14 19:41:26,305 [salt.state       ][INFO    ][30283] Executing state cmd.wait for cat /etc/salt/grains.d/* > /etc/salt/grains
2017-09-14 19:41:26,306 [salt.state       ][INFO    ][30283] No changes made for cat /etc/salt/grains.d/* > /etc/salt/grains
2017-09-14 19:41:26,306 [salt.state       ][INFO    ][30283] Completed state [cat /etc/salt/grains.d/* > /etc/salt/grains] at time 19:41:26.306574 duration_in_ms=1.813
2017-09-14 19:41:26,308 [salt.state       ][INFO    ][30283] Running state [mine.update] at time 19:41:26.308174
2017-09-14 19:41:26,308 [salt.state       ][INFO    ][30283] Executing state module.wait for mine.update
2017-09-14 19:41:26,309 [salt.state       ][INFO    ][30283] No changes made for mine.update
2017-09-14 19:41:26,309 [salt.state       ][INFO    ][30283] Completed state [mine.update] at time 19:41:26.309862 duration_in_ms=1.688
2017-09-14 19:41:26,310 [salt.state       ][INFO    ][30283] Running state [/etc/pki/ca/salt_master_ca/certs] at time 19:41:26.310398
2017-09-14 19:41:26,310 [salt.state       ][INFO    ][30283] Executing state file.directory for /etc/pki/ca/salt_master_ca/certs
2017-09-14 19:41:26,311 [salt.state       ][INFO    ][30283] Directory /etc/pki/ca/salt_master_ca/certs is in the correct state
2017-09-14 19:41:26,312 [salt.state       ][INFO    ][30283] Completed state [/etc/pki/ca/salt_master_ca/certs] at time 19:41:26.312414 duration_in_ms=2.016
2017-09-14 19:41:26,313 [salt.state       ][INFO    ][30283] Running state [/etc/pki/ca/salt_master_ca] at time 19:41:26.313015
2017-09-14 19:41:26,313 [salt.state       ][INFO    ][30283] Executing state file.directory for /etc/pki/ca/salt_master_ca
2017-09-14 19:41:26,314 [salt.state       ][INFO    ][30283] Directory /etc/pki/ca/salt_master_ca is in the correct state
2017-09-14 19:41:26,315 [salt.state       ][INFO    ][30283] Completed state [/etc/pki/ca/salt_master_ca] at time 19:41:26.314963 duration_in_ms=1.947
2017-09-14 19:41:26,317 [salt.state       ][INFO    ][30283] Running state [/etc/pki/ca/salt_master_ca/ca.key] at time 19:41:26.317121
2017-09-14 19:41:26,317 [salt.state       ][INFO    ][30283] Executing state x509.private_key_managed for /etc/pki/ca/salt_master_ca/ca.key
2017-09-14 19:41:26,325 [salt.state       ][INFO    ][30283] File /etc/pki/ca/salt_master_ca/ca.key is in the correct state
2017-09-14 19:41:26,326 [salt.state       ][INFO    ][30283] Completed state [/etc/pki/ca/salt_master_ca/ca.key] at time 19:41:26.326371 duration_in_ms=9.251
2017-09-14 19:41:26,328 [salt.state       ][INFO    ][30283] Running state [/etc/pki/ca/salt_master_ca/ca.key] at time 19:41:26.327937
2017-09-14 19:41:26,328 [salt.state       ][INFO    ][30283] Executing state file.managed for /etc/pki/ca/salt_master_ca/ca.key
2017-09-14 19:41:26,329 [salt.state       ][INFO    ][30283] File /etc/pki/ca/salt_master_ca/ca.key exists with proper permissions. No changes made.
2017-09-14 19:41:26,330 [salt.state       ][INFO    ][30283] Completed state [/etc/pki/ca/salt_master_ca/ca.key] at time 19:41:26.330089 duration_in_ms=2.153
2017-09-14 19:41:26,331 [salt.state       ][INFO    ][30283] Running state [/etc/pki/ca/salt_master_ca/ca.crt] at time 19:41:26.331365
2017-09-14 19:41:26,331 [salt.state       ][INFO    ][30283] Executing state x509.certificate_managed for /etc/pki/ca/salt_master_ca/ca.crt
2017-09-14 19:41:26,349 [salt.state       ][INFO    ][30283] File /etc/pki/ca/salt_master_ca/ca.crt is in the correct state
2017-09-14 19:41:26,350 [salt.state       ][INFO    ][30283] Completed state [/etc/pki/ca/salt_master_ca/ca.crt] at time 19:41:26.350229 duration_in_ms=18.865
2017-09-14 19:41:26,351 [salt.state       ][INFO    ][30283] Running state [/etc/pki/ca/salt_master_ca/ca.crt] at time 19:41:26.351776
2017-09-14 19:41:26,352 [salt.state       ][INFO    ][30283] Executing state file.managed for /etc/pki/ca/salt_master_ca/ca.crt
2017-09-14 19:41:26,353 [salt.loaded.int.states.file][WARNING ][30283] State for file: /etc/pki/ca/salt_master_ca/ca.crt - Neither 'source' nor 'contents' nor 'contents_pillar' nor 'contents_grains' was defined, yet 'replace' was set to 'True'. As there is no source to replace the file with, 'replace' has been set to 'False' to avoid reading the file unnecessarily.
2017-09-14 19:41:26,353 [salt.state       ][INFO    ][30283] File /etc/pki/ca/salt_master_ca/ca.crt exists with proper permissions. No changes made.
2017-09-14 19:41:26,354 [salt.state       ][INFO    ][30283] Completed state [/etc/pki/ca/salt_master_ca/ca.crt] at time 19:41:26.354416 duration_in_ms=2.639
2017-09-14 19:41:26,355 [salt.state       ][INFO    ][30283] Running state [mine.send] at time 19:41:26.355708
2017-09-14 19:41:26,356 [salt.state       ][INFO    ][30283] Executing state module.run for mine.send
2017-09-14 19:41:26,865 [salt.state       ][INFO    ][30283] {'ret': True}
2017-09-14 19:41:26,865 [salt.state       ][INFO    ][30283] Completed state [mine.send] at time 19:41:26.865571 duration_in_ms=509.861
2017-09-14 19:41:26,866 [salt.state       ][INFO    ][30283] Running state [ca-certificates] at time 19:41:26.866078
2017-09-14 19:41:26,866 [salt.state       ][INFO    ][30283] Executing state pkg.installed for ca-certificates
2017-09-14 19:41:26,877 [salt.state       ][INFO    ][30283] Package ca-certificates is already installed
2017-09-14 19:41:26,878 [salt.state       ][INFO    ][30283] Completed state [ca-certificates] at time 19:41:26.878198 duration_in_ms=12.119
2017-09-14 19:41:26,880 [salt.state       ][INFO    ][30283] Running state [update-ca-certificates] at time 19:41:26.880072
2017-09-14 19:41:26,880 [salt.state       ][INFO    ][30283] Executing state cmd.wait for update-ca-certificates
2017-09-14 19:41:26,881 [salt.state       ][INFO    ][30283] No changes made for update-ca-certificates
2017-09-14 19:41:26,881 [salt.state       ][INFO    ][30283] Completed state [update-ca-certificates] at time 19:41:26.881306 duration_in_ms=1.234
2017-09-14 19:41:26,881 [salt.state       ][INFO    ][30283] Running state [salt-api] at time 19:41:26.881698
2017-09-14 19:41:26,882 [salt.state       ][INFO    ][30283] Executing state pkg.installed for salt-api
2017-09-14 19:41:26,890 [salt.state       ][INFO    ][30283] Package salt-api is already installed
2017-09-14 19:41:26,891 [salt.state       ][INFO    ][30283] Completed state [salt-api] at time 19:41:26.891161 duration_in_ms=9.463
2017-09-14 19:41:26,892 [salt.state       ][INFO    ][30283] Running state [/etc/salt/master.d/_api.conf] at time 19:41:26.892788
2017-09-14 19:41:26,893 [salt.state       ][INFO    ][30283] Executing state file.managed for /etc/salt/master.d/_api.conf
2017-09-14 19:41:27,052 [salt.state       ][INFO    ][30283] File /etc/salt/master.d/_api.conf is in the correct state
2017-09-14 19:41:27,052 [salt.state       ][INFO    ][30283] Completed state [/etc/salt/master.d/_api.conf] at time 19:41:27.052600 duration_in_ms=159.812
2017-09-14 19:41:27,054 [salt.state       ][INFO    ][30283] Running state [salt-api] at time 19:41:27.054781
2017-09-14 19:41:27,055 [salt.state       ][INFO    ][30283] Executing state service.running for salt-api
2017-09-14 19:41:27,055 [salt.loaded.int.module.cmdmod][INFO    ][30283] Executing command ['systemctl', 'status', 'salt-api.service', '-n', '0'] in directory '/root'
2017-09-14 19:41:27,070 [salt.loaded.int.module.cmdmod][INFO    ][30283] Executing command ['systemctl', 'is-active', 'salt-api.service'] in directory '/root'
2017-09-14 19:41:27,082 [salt.loaded.int.module.cmdmod][INFO    ][30283] Executing command ['systemctl', 'is-enabled', 'salt-api.service'] in directory '/root'
2017-09-14 19:41:27,093 [salt.state       ][INFO    ][30283] The service salt-api is already running
2017-09-14 19:41:27,094 [salt.state       ][INFO    ][30283] Completed state [salt-api] at time 19:41:27.094013 duration_in_ms=39.232
2017-09-14 19:41:27,100 [salt.minion      ][INFO    ][30283] Returning information for job: 20170914194116002080
2017-09-14 19:41:27,763 [salt.minion      ][INFO    ][30118] User sudo_ubuntu Executing command state.sls with jid 20170914194127750869
2017-09-14 19:41:27,781 [salt.minion      ][INFO    ][30630] Starting a new job with PID 30630
2017-09-14 19:41:28,145 [salt.state       ][INFO    ][30630] Loading fresh modules for state activity
2017-09-14 19:41:28,174 [salt.fileclient  ][INFO    ][30630] Fetching file from saltenv 'base', ** done ** 'linux/init.sls'
2017-09-14 19:41:28,197 [salt.fileclient  ][INFO    ][30630] Fetching file from saltenv 'base', ** done ** 'linux/system/init.sls'
2017-09-14 19:41:28,264 [salt.fileclient  ][INFO    ][30630] Fetching file from saltenv 'base', ** done ** 'linux/system/env.sls'
2017-09-14 19:41:28,320 [salt.fileclient  ][INFO    ][30630] Fetching file from saltenv 'base', ** done ** 'linux/system/profile.sls'
2017-09-14 19:41:28,375 [salt.fileclient  ][INFO    ][30630] Fetching file from saltenv 'base', ** done ** 'linux/system/repo.sls'
2017-09-14 19:41:28,483 [salt.fileclient  ][INFO    ][30630] Fetching file from saltenv 'base', ** done ** 'linux/system/package.sls'
2017-09-14 19:41:28,547 [salt.fileclient  ][INFO    ][30630] Fetching file from saltenv 'base', ** done ** 'linux/system/timezone.sls'
2017-09-14 19:41:28,599 [salt.fileclient  ][INFO    ][30630] Fetching file from saltenv 'base', ** done ** 'linux/system/kernel.sls'
2017-09-14 19:41:28,672 [salt.fileclient  ][INFO    ][30630] Fetching file from saltenv 'base', ** done ** 'linux/system/cpu.sls'
2017-09-14 19:41:28,724 [salt.fileclient  ][INFO    ][30630] Fetching file from saltenv 'base', ** done ** 'linux/system/sysfs.sls'
2017-09-14 19:41:28,775 [salt.fileclient  ][INFO    ][30630] Fetching file from saltenv 'base', ** done ** 'linux/system/locale.sls'
2017-09-14 19:41:28,969 [salt.fileclient  ][INFO    ][30630] Fetching file from saltenv 'base', ** done ** 'linux/system/limit.sls'
2017-09-14 19:41:29,046 [salt.fileclient  ][INFO    ][30630] Fetching file from saltenv 'base', ** done ** 'linux/system/systemd.sls'
2017-09-14 19:41:29,119 [salt.fileclient  ][INFO    ][30630] Fetching file from saltenv 'base', ** done ** 'linux/network/init.sls'
2017-09-14 19:41:29,175 [salt.fileclient  ][INFO    ][30630] Fetching file from saltenv 'base', ** done ** 'linux/network/hostname.sls'
2017-09-14 19:41:29,226 [salt.fileclient  ][INFO    ][30630] Fetching file from saltenv 'base', ** done ** 'linux/network/host.sls'
2017-09-14 19:41:29,318 [salt.fileclient  ][INFO    ][30630] Fetching file from saltenv 'base', ** done ** 'linux/network/interface.sls'
2017-09-14 19:41:29,412 [salt.fileclient  ][INFO    ][30630] Fetching file from saltenv 'base', ** done ** 'linux/network/proxy.sls'
2017-09-14 19:41:29,464 [salt.fileclient  ][INFO    ][30630] Fetching file from saltenv 'base', ** done ** 'linux/storage/init.sls'
2017-09-14 19:41:29,515 [salt.state       ][INFO    ][30630] Running state [/etc/environment] at time 19:41:29.515236
2017-09-14 19:41:29,515 [salt.state       ][INFO    ][30630] Executing state file.blockreplace for /etc/environment
2017-09-14 19:41:29,521 [salt.state       ][INFO    ][30630] File changed:
--- 
+++ 
@@ -1 +1,4 @@
 PATH="/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/usr/games:/usr/local/games"
+# SALT MANAGED VARIABLES - DO NOT EDIT - START
+# +# SALT MANAGED VARIABLES - END

2017-09-14 19:41:29,522 [salt.state       ][INFO    ][30630] Completed state [/etc/environment] at time 19:41:29.522668 duration_in_ms=7.433
2017-09-14 19:41:29,522 [salt.state       ][INFO    ][30630] Running state [/etc/profile.d] at time 19:41:29.522944
2017-09-14 19:41:29,523 [salt.state       ][INFO    ][30630] Executing state file.directory for /etc/profile.d
2017-09-14 19:41:29,524 [salt.state       ][INFO    ][30630] Directory /etc/profile.d is in the correct state
2017-09-14 19:41:29,524 [salt.state       ][INFO    ][30630] Completed state [/etc/profile.d] at time 19:41:29.524331 duration_in_ms=1.387
2017-09-14 19:41:29,844 [salt.state       ][INFO    ][30630] Running state [linux_repo_prereq_pkgs] at time 19:41:29.844597
2017-09-14 19:41:29,845 [salt.state       ][INFO    ][30630] Executing state pkg.installed for linux_repo_prereq_pkgs
2017-09-14 19:41:29,845 [salt.loaded.int.module.cmdmod][INFO    ][30630] Executing command ['dpkg-query', '--showformat', '${Status} ${Package} ${Version} ${Architecture}\n', '-W'] in directory '/root'
2017-09-14 19:41:30,227 [salt.state       ][INFO    ][30630] All specified packages are already installed
2017-09-14 19:41:30,228 [salt.state       ][INFO    ][30630] Completed state [linux_repo_prereq_pkgs] at time 19:41:30.228251 duration_in_ms=383.654
2017-09-14 19:41:30,228 [salt.state       ][INFO    ][30630] Running state [/etc/apt/apt.conf.d/99proxies-salt-salt] at time 19:41:30.228646
2017-09-14 19:41:30,229 [salt.state       ][INFO    ][30630] Executing state file.absent for /etc/apt/apt.conf.d/99proxies-salt-salt
2017-09-14 19:41:30,229 [salt.state       ][INFO    ][30630] File /etc/apt/apt.conf.d/99proxies-salt-salt is not present
2017-09-14 19:41:30,229 [salt.state       ][INFO    ][30630] Completed state [/etc/apt/apt.conf.d/99proxies-salt-salt] at time 19:41:30.229839 duration_in_ms=1.193
2017-09-14 19:41:30,230 [salt.state       ][INFO    ][30630] Running state [/etc/apt/preferences.d/salt] at time 19:41:30.230188
2017-09-14 19:41:30,230 [salt.state       ][INFO    ][30630] Executing state file.absent for /etc/apt/preferences.d/salt
2017-09-14 19:41:30,230 [salt.state       ][INFO    ][30630] File /etc/apt/preferences.d/salt is not present
2017-09-14 19:41:30,231 [salt.state       ][INFO    ][30630] Completed state [/etc/apt/preferences.d/salt] at time 19:41:30.231143 duration_in_ms=0.955
2017-09-14 19:41:30,234 [salt.state       ][INFO    ][30630] Running state [deb http://repo.saltstack.com/apt/ubuntu/16.04/amd64/2016.3 xenial main] at time 19:41:30.234001
2017-09-14 19:41:30,234 [salt.state       ][INFO    ][30630] Executing state pkgrepo.managed for deb http://repo.saltstack.com/apt/ubuntu/16.04/amd64/2016.3 xenial main
2017-09-14 19:41:30,530 [salt.loaded.int.module.cmdmod][INFO    ][30630] Executing command ['apt-key', 'add', '/var/cache/salt/minion/extrn_files/base/repo.saltstack.com/apt/ubuntu/16.04/amd64/2016.3/SALTSTACK-GPG-KEY.pub'] in directory '/root'
2017-09-14 19:41:30,720 [salt.loaded.int.module.cmdmod][INFO    ][30630] Executing command ['apt-get', '-q', 'update'] in directory '/root'
2017-09-14 19:41:34,090 [salt.state       ][INFO    ][30630] {'repo': 'deb http://repo.saltstack.com/apt/ubuntu/16.04/amd64/2016.3 xenial main'}
2017-09-14 19:41:34,091 [salt.state       ][INFO    ][30630] Completed state [deb http://repo.saltstack.com/apt/ubuntu/16.04/amd64/2016.3 xenial main] at time 19:41:34.091504 duration_in_ms=3857.502
2017-09-14 19:41:34,091 [salt.state       ][INFO    ][30630] Running state [/etc/apt/apt.conf.d/99proxies-salt-uca] at time 19:41:34.091909
2017-09-14 19:41:34,092 [salt.state       ][INFO    ][30630] Executing state file.absent for /etc/apt/apt.conf.d/99proxies-salt-uca
2017-09-14 19:41:34,092 [salt.state       ][INFO    ][30630] File /etc/apt/apt.conf.d/99proxies-salt-uca is not present
2017-09-14 19:41:34,092 [salt.state       ][INFO    ][30630] Completed state [/etc/apt/apt.conf.d/99proxies-salt-uca] at time 19:41:34.092944 duration_in_ms=1.034
2017-09-14 19:41:34,093 [salt.state       ][INFO    ][30630] Running state [/etc/apt/preferences.d/uca] at time 19:41:34.093227
2017-09-14 19:41:34,093 [salt.state       ][INFO    ][30630] Executing state file.absent for /etc/apt/preferences.d/uca
2017-09-14 19:41:34,093 [salt.state       ][INFO    ][30630] File /etc/apt/preferences.d/uca is not present
2017-09-14 19:41:34,094 [salt.state       ][INFO    ][30630] Completed state [/etc/apt/preferences.d/uca] at time 19:41:34.094118 duration_in_ms=0.891
2017-09-14 19:41:34,094 [salt.state       ][INFO    ][30630] Running state [deb http://ubuntu-cloud.archive.canonical.com/ubuntu xenial-updates/ocata main] at time 19:41:34.094884
2017-09-14 19:41:34,095 [salt.state       ][INFO    ][30630] Executing state pkgrepo.managed for deb http://ubuntu-cloud.archive.canonical.com/ubuntu xenial-updates/ocata main
2017-09-14 19:41:34,141 [salt.loaded.int.module.cmdmod][INFO    ][30630] Executing command ['apt-key', 'export', 'EC4926EA'] in directory '/root'
2017-09-14 19:41:34,202 [salt.loaded.int.module.cmdmod][INFO    ][30630] Executing command ['apt-key', 'adv', '--keyserver', 'keyserver.ubuntu.com', '--logger-fd', '1', '--recv-keys', 'EC4926EA'] in directory '/root'
2017-09-14 19:41:34,847 [salt.loaded.int.module.cmdmod][INFO    ][30630] Executing command ['apt-get', '-q', 'update'] in directory '/root'
2017-09-14 19:41:37,858 [salt.minion      ][INFO    ][30118] User sudo_ubuntu Executing command saltutil.find_job with jid 20170914194137847495
2017-09-14 19:41:37,888 [salt.minion      ][INFO    ][31694] Starting a new job with PID 31694
2017-09-14 19:41:37,906 [salt.minion      ][INFO    ][31694] Returning information for job: 20170914194137847495
2017-09-14 19:41:39,470 [salt.state       ][INFO    ][30630] {'repo': 'deb http://ubuntu-cloud.archive.canonical.com/ubuntu xenial-updates/ocata main'}
2017-09-14 19:41:39,470 [salt.state       ][INFO    ][30630] Completed state [deb http://ubuntu-cloud.archive.canonical.com/ubuntu xenial-updates/ocata main] at time 19:41:39.470784 duration_in_ms=5375.9
2017-09-14 19:41:39,471 [salt.state       ][INFO    ][30630] Running state [/etc/apt/apt.conf.d/99proxies-salt-mcp_salt] at time 19:41:39.471141
2017-09-14 19:41:39,471 [salt.state       ][INFO    ][30630] Executing state file.absent for /etc/apt/apt.conf.d/99proxies-salt-mcp_salt
2017-09-14 19:41:39,471 [salt.state       ][INFO    ][30630] File /etc/apt/apt.conf.d/99proxies-salt-mcp_salt is not present
2017-09-14 19:41:39,472 [salt.state       ][INFO    ][30630] Completed state [/etc/apt/apt.conf.d/99proxies-salt-mcp_salt] at time 19:41:39.472168 duration_in_ms=1.027
2017-09-14 19:41:39,472 [salt.state       ][INFO    ][30630] Running state [/etc/apt/preferences.d/mcp_salt] at time 19:41:39.472454
2017-09-14 19:41:39,472 [salt.state       ][INFO    ][30630] Executing state file.managed for /etc/apt/preferences.d/mcp_salt
2017-09-14 19:41:39,487 [salt.fileclient  ][INFO    ][30630] Fetching file from saltenv 'base', ** done ** 'linux/files/preferences_repo'
2017-09-14 19:41:39,531 [salt.state       ][INFO    ][30630] File changed:
New file
2017-09-14 19:41:39,532 [salt.state       ][INFO    ][30630] Completed state [/etc/apt/preferences.d/mcp_salt] at time 19:41:39.532074 duration_in_ms=59.619
2017-09-14 19:41:39,532 [salt.state       ][INFO    ][30630] Running state [deb [arch=amd64] http://apt-mk.mirantis.com/xenial/ nightly salt] at time 19:41:39.532826
2017-09-14 19:41:39,533 [salt.state       ][INFO    ][30630] Executing state pkgrepo.managed for deb [arch=amd64] http://apt-mk.mirantis.com/xenial/ nightly salt
2017-09-14 19:41:39,946 [salt.loaded.int.module.cmdmod][INFO    ][30630] Executing command ['apt-key', 'add', '/var/cache/salt/minion/extrn_files/base/apt-mk.mirantis.com/public.gpg'] in directory '/root'
2017-09-14 19:41:40,119 [salt.loaded.int.module.cmdmod][INFO    ][30630] Executing command ['apt-get', '-q', 'update'] in directory '/root'
2017-09-14 19:41:44,036 [salt.state       ][INFO    ][30630] Made the following changes:
'file' changed from '/etc/apt/sources.list.d/bootstrap.list' to '/etc/apt/sources.list.d/mcp_salt.list'

2017-09-14 19:41:44,036 [salt.state       ][INFO    ][30630] Completed state [deb [arch=amd64] http://apt-mk.mirantis.com/xenial/ nightly salt] at time 19:41:44.036778 duration_in_ms=4503.951
2017-09-14 19:41:44,037 [salt.state       ][INFO    ][30630] Running state [linux_extra_packages_purged] at time 19:41:44.037177
2017-09-14 19:41:44,037 [salt.state       ][INFO    ][30630] Executing state pkg.purged for linux_extra_packages_purged
2017-09-14 19:41:44,058 [salt.loaded.int.module.cmdmod][INFO    ][30630] Executing command ['systemd-run', '--scope', 'apt-get', '-q', '-y', 'purge', 'cloud-init'] in directory '/root'
2017-09-14 19:41:47,804 [salt.loaded.int.module.cmdmod][INFO    ][30630] Executing command ['dpkg-query', '--showformat', '${Status} ${Package} ${Version} ${Architecture}\n', '-W'] in directory '/root'
2017-09-14 19:41:47,856 [salt.state       ][INFO    ][30630] {'removed': {}, 'installed': {'cloud-init': {'new': '', 'old': '0.7.9-153-g16a7302f-0ubuntu1~16.04.2'}, 'ec2-init': {'new': '', 'old': '1'}}}
2017-09-14 19:41:47,875 [salt.state       ][INFO    ][30630] Loading fresh modules for state activity
2017-09-14 19:41:47,904 [salt.state       ][INFO    ][30630] Completed state [linux_extra_packages_purged] at time 19:41:47.904196 duration_in_ms=3867.017
2017-09-14 19:41:47,908 [salt.state       ][INFO    ][30630] Running state [linux_extra_packages_latest] at time 19:41:47.908472
2017-09-14 19:41:47,908 [salt.state       ][INFO    ][30630] Executing state pkg.latest for linux_extra_packages_latest
2017-09-14 19:41:48,207 [salt.loaded.int.module.cmdmod][INFO    ][30630] Executing command ['apt-cache', '-q', 'policy', 'mcelog'] in directory '/root'
2017-09-14 19:41:48,238 [salt.loaded.int.module.cmdmod][INFO    ][30630] Executing command ['apt-cache', '-q', 'policy', 'python-msgpack'] in directory '/root'
2017-09-14 19:41:48,274 [salt.loaded.int.module.cmdmod][INFO    ][30630] Executing command ['dpkg', '--get-selections', '*'] in directory '/root'
2017-09-14 19:41:48,292 [salt.loaded.int.module.cmdmod][INFO    ][30630] Executing command ['systemd-run', '--scope', 'apt-get', '-q', '-y', '-o', 'DPkg::Options::=--force-confold', '-o', 'DPkg::Options::=--force-confdef', 'install', 'mcelog'] in directory '/root'
2017-09-14 19:41:48,323 [salt.minion      ][INFO    ][30118] User sudo_ubuntu Executing command saltutil.find_job with jid 20170914194148052087
2017-09-14 19:41:48,350 [salt.minion      ][INFO    ][32394] Starting a new job with PID 32394
2017-09-14 19:41:48,366 [salt.minion      ][INFO    ][32394] Returning information for job: 20170914194148052087
2017-09-14 19:41:54,205 [salt.loaded.int.module.cmdmod][INFO    ][30630] Executing command ['dpkg-query', '--showformat', '${Status} ${Package} ${Version} ${Architecture}\n', '-W'] in directory '/root'
2017-09-14 19:41:54,232 [salt.state       ][INFO    ][30630] Made the following changes:
'mcelog' changed from 'absent' to '128+dfsg-1'

2017-09-14 19:41:54,241 [salt.state       ][INFO    ][30630] Loading fresh modules for state activity
2017-09-14 19:41:54,261 [salt.state       ][INFO    ][30630] Completed state [linux_extra_packages_latest] at time 19:41:54.261697 duration_in_ms=6353.223
2017-09-14 19:41:54,267 [salt.state       ][INFO    ][30630] Running state [UTC] at time 19:41:54.267057
2017-09-14 19:41:54,267 [salt.state       ][INFO    ][30630] Executing state timezone.system for UTC
2017-09-14 19:41:54,271 [salt.loaded.int.module.cmdmod][INFO    ][30630] Executing command ['timedatectl'] in directory '/root'
2017-09-14 19:41:54,363 [salt.loaded.int.module.cmdmod][INFO    ][30630] Executing command ['timedatectl'] in directory '/root'
2017-09-14 19:41:54,377 [salt.loaded.int.module.cmdmod][INFO    ][30630] Executing command 'timedatectl set-timezone UTC' in directory '/root'
2017-09-14 19:41:54,393 [salt.state       ][INFO    ][30630] {'timezone': 'UTC'}
2017-09-14 19:41:54,393 [salt.state       ][INFO    ][30630] Completed state [UTC] at time 19:41:54.393840 duration_in_ms=126.783
2017-09-14 19:41:54,396 [salt.state       ][INFO    ][30630] Running state [nf_conntrack] at time 19:41:54.396626
2017-09-14 19:41:54,397 [salt.state       ][INFO    ][30630] Executing state kmod.present for nf_conntrack
2017-09-14 19:41:54,397 [salt.loaded.int.module.cmdmod][INFO    ][30630] Executing command 'lsmod' in directory '/root'
2017-09-14 19:41:54,511 [salt.loaded.int.module.cmdmod][INFO    ][30630] Executing command 'lsmod' in directory '/root'
2017-09-14 19:41:54,522 [salt.loaded.int.module.cmdmod][INFO    ][30630] Executing command 'modprobe nf_conntrack' in directory '/root'
2017-09-14 19:41:54,543 [salt.loaded.int.module.cmdmod][INFO    ][30630] Executing command 'lsmod' in directory '/root'
2017-09-14 19:41:54,572 [salt.state       ][INFO    ][30630] {'nf_conntrack': 'loaded'}
2017-09-14 19:41:54,572 [salt.state       ][INFO    ][30630] Completed state [nf_conntrack] at time 19:41:54.572368 duration_in_ms=175.742
2017-09-14 19:41:54,575 [salt.state       ][INFO    ][30630] Running state [net.ipv4.tcp_keepalive_probes] at time 19:41:54.575067
2017-09-14 19:41:54,575 [salt.state       ][INFO    ][30630] Executing state sysctl.present for net.ipv4.tcp_keepalive_probes
2017-09-14 19:41:54,575 [salt.loaded.int.module.cmdmod][INFO    ][30630] Executing command 'sysctl -a' in directory '/root'
2017-09-14 19:41:54,614 [salt.loaded.int.module.cmdmod][INFO    ][30630] Executing command 'sysctl -w net.ipv4.tcp_keepalive_probes="8"' in directory '/root'
2017-09-14 19:41:54,622 [salt.state       ][INFO    ][30630] {'net.ipv4.tcp_keepalive_probes': 8}
2017-09-14 19:41:54,622 [salt.state       ][INFO    ][30630] Completed state [net.ipv4.tcp_keepalive_probes] at time 19:41:54.622352 duration_in_ms=47.285
2017-09-14 19:41:54,622 [salt.state       ][INFO    ][30630] Running state [fs.file-max] at time 19:41:54.622717
2017-09-14 19:41:54,623 [salt.state       ][INFO    ][30630] Executing state sysctl.present for fs.file-max
2017-09-14 19:41:54,623 [salt.loaded.int.module.cmdmod][INFO    ][30630] Executing command 'sysctl -a' in directory '/root'
2017-09-14 19:41:54,642 [salt.loaded.int.module.cmdmod][INFO    ][30630] Executing command 'sysctl -w fs.file-max="124165"' in directory '/root'
2017-09-14 19:41:54,649 [salt.state       ][INFO    ][30630] {'fs.file-max': 124165}
2017-09-14 19:41:54,649 [salt.state       ][INFO    ][30630] Completed state [fs.file-max] at time 19:41:54.649844 duration_in_ms=27.127
2017-09-14 19:41:54,650 [salt.state       ][INFO    ][30630] Running state [net.core.somaxconn] at time 19:41:54.650193
2017-09-14 19:41:54,650 [salt.state       ][INFO    ][30630] Executing state sysctl.present for net.core.somaxconn
2017-09-14 19:41:54,651 [salt.loaded.int.module.cmdmod][INFO    ][30630] Executing command 'sysctl -a' in directory '/root'
2017-09-14 19:41:54,667 [salt.loaded.int.module.cmdmod][INFO    ][30630] Executing command 'sysctl -w net.core.somaxconn="4096"' in directory '/root'
2017-09-14 19:41:54,675 [salt.state       ][INFO    ][30630] {'net.core.somaxconn': 4096}
2017-09-14 19:41:54,676 [salt.state       ][INFO    ][30630] Completed state [net.core.somaxconn] at time 19:41:54.676157 duration_in_ms=25.963
2017-09-14 19:41:54,676 [salt.state       ][INFO    ][30630] Running state [net.ipv4.tcp_max_syn_backlog] at time 19:41:54.676684
2017-09-14 19:41:54,677 [salt.state       ][INFO    ][30630] Executing state sysctl.present for net.ipv4.tcp_max_syn_backlog
2017-09-14 19:41:54,678 [salt.loaded.int.module.cmdmod][INFO    ][30630] Executing command 'sysctl -a' in directory '/root'
2017-09-14 19:41:54,695 [salt.loaded.int.module.cmdmod][INFO    ][30630] Executing command 'sysctl -w net.ipv4.tcp_max_syn_backlog="8192"' in directory '/root'
2017-09-14 19:41:54,703 [salt.state       ][INFO    ][30630] {'net.ipv4.tcp_max_syn_backlog': 8192}
2017-09-14 19:41:54,704 [salt.state       ][INFO    ][30630] Completed state [net.ipv4.tcp_max_syn_backlog] at time 19:41:54.704232 duration_in_ms=27.548
2017-09-14 19:41:54,704 [salt.state       ][INFO    ][30630] Running state [net.ipv4.tcp_tw_reuse] at time 19:41:54.704717
2017-09-14 19:41:54,705 [salt.state       ][INFO    ][30630] Executing state sysctl.present for net.ipv4.tcp_tw_reuse
2017-09-14 19:41:54,705 [salt.loaded.int.module.cmdmod][INFO    ][30630] Executing command 'sysctl -a' in directory '/root'
2017-09-14 19:41:54,722 [salt.loaded.int.module.cmdmod][INFO    ][30630] Executing command 'sysctl -w net.ipv4.tcp_tw_reuse="1"' in directory '/root'
2017-09-14 19:41:54,729 [salt.state       ][INFO    ][30630] {'net.ipv4.tcp_tw_reuse': 1}
2017-09-14 19:41:54,730 [salt.state       ][INFO    ][30630] Completed state [net.ipv4.tcp_tw_reuse] at time 19:41:54.729965 duration_in_ms=25.248
2017-09-14 19:41:54,730 [salt.state       ][INFO    ][30630] Running state [net.ipv4.tcp_congestion_control] at time 19:41:54.730444
2017-09-14 19:41:54,730 [salt.state       ][INFO    ][30630] Executing state sysctl.present for net.ipv4.tcp_congestion_control
2017-09-14 19:41:54,731 [salt.loaded.int.module.cmdmod][INFO    ][30630] Executing command 'sysctl -a' in directory '/root'
2017-09-14 19:41:54,747 [salt.loaded.int.module.cmdmod][INFO    ][30630] Executing command 'sysctl -w net.ipv4.tcp_congestion_control="yeah"' in directory '/root'
2017-09-14 19:41:54,765 [salt.state       ][INFO    ][30630] {'net.ipv4.tcp_congestion_control': 'yeah'}
2017-09-14 19:41:54,765 [salt.state       ][INFO    ][30630] Completed state [net.ipv4.tcp_congestion_control] at time 19:41:54.765566 duration_in_ms=35.122
2017-09-14 19:41:54,766 [salt.state       ][INFO    ][30630] Running state [net.nf_conntrack_max] at time 19:41:54.766076
2017-09-14 19:41:54,766 [salt.state       ][INFO    ][30630] Executing state sysctl.present for net.nf_conntrack_max
2017-09-14 19:41:54,767 [salt.loaded.int.module.cmdmod][INFO    ][30630] Executing command 'sysctl -a' in directory '/root'
2017-09-14 19:41:54,783 [salt.loaded.int.module.cmdmod][INFO    ][30630] Executing command 'sysctl -w net.nf_conntrack_max="1048576"' in directory '/root'
2017-09-14 19:41:54,790 [salt.state       ][INFO    ][30630] {'net.nf_conntrack_max': 1048576}
2017-09-14 19:41:54,791 [salt.state       ][INFO    ][30630] Completed state [net.nf_conntrack_max] at time 19:41:54.791328 duration_in_ms=25.252
2017-09-14 19:41:54,791 [salt.state       ][INFO    ][30630] Running state [net.ipv4.tcp_retries2] at time 19:41:54.791806
2017-09-14 19:41:54,792 [salt.state       ][INFO    ][30630] Executing state sysctl.present for net.ipv4.tcp_retries2
2017-09-14 19:41:54,792 [salt.loaded.int.module.cmdmod][INFO    ][30630] Executing command 'sysctl -a' in directory '/root'
2017-09-14 19:41:54,809 [salt.loaded.int.module.cmdmod][INFO    ][30630] Executing command 'sysctl -w net.ipv4.tcp_retries2="5"' in directory '/root'
2017-09-14 19:41:54,817 [salt.state       ][INFO    ][30630] {'net.ipv4.tcp_retries2': 5}
2017-09-14 19:41:54,818 [salt.state       ][INFO    ][30630] Completed state [net.ipv4.tcp_retries2] at time 19:41:54.818012 duration_in_ms=26.206
2017-09-14 19:41:54,818 [salt.state       ][INFO    ][30630] Running state [net.ipv4.tcp_keepalive_intvl] at time 19:41:54.818457
2017-09-14 19:41:54,818 [salt.state       ][INFO    ][30630] Executing state sysctl.present for net.ipv4.tcp_keepalive_intvl
2017-09-14 19:41:54,819 [salt.loaded.int.module.cmdmod][INFO    ][30630] Executing command 'sysctl -a' in directory '/root'
2017-09-14 19:41:54,834 [salt.loaded.int.module.cmdmod][INFO    ][30630] Executing command 'sysctl -w net.ipv4.tcp_keepalive_intvl="3"' in directory '/root'
2017-09-14 19:41:54,842 [salt.state       ][INFO    ][30630] {'net.ipv4.tcp_keepalive_intvl': 3}
2017-09-14 19:41:54,842 [salt.state       ][INFO    ][30630] Completed state [net.ipv4.tcp_keepalive_intvl] at time 19:41:54.842573 duration_in_ms=24.116
2017-09-14 19:41:54,843 [salt.state       ][INFO    ][30630] Running state [net.ipv4.tcp_slow_start_after_idle] at time 19:41:54.843020
2017-09-14 19:41:54,843 [salt.state       ][INFO    ][30630] Executing state sysctl.present for net.ipv4.tcp_slow_start_after_idle
2017-09-14 19:41:54,844 [salt.loaded.int.module.cmdmod][INFO    ][30630] Executing command 'sysctl -a' in directory '/root'
2017-09-14 19:41:54,860 [salt.loaded.int.module.cmdmod][INFO    ][30630] Executing command 'sysctl -w net.ipv4.tcp_slow_start_after_idle="0"' in directory '/root'
2017-09-14 19:41:54,867 [salt.state       ][INFO    ][30630] {'net.ipv4.tcp_slow_start_after_idle': 0}
2017-09-14 19:41:54,868 [salt.state       ][INFO    ][30630] Completed state [net.ipv4.tcp_slow_start_after_idle] at time 19:41:54.868024 duration_in_ms=25.004
2017-09-14 19:41:54,868 [salt.state       ][INFO    ][30630] Running state [vm.swappiness] at time 19:41:54.868476
2017-09-14 19:41:54,868 [salt.state       ][INFO    ][30630] Executing state sysctl.present for vm.swappiness
2017-09-14 19:41:54,869 [salt.loaded.int.module.cmdmod][INFO    ][30630] Executing command 'sysctl -a' in directory '/root'
2017-09-14 19:41:54,885 [salt.loaded.int.module.cmdmod][INFO    ][30630] Executing command 'sysctl -w vm.swappiness="10"' in directory '/root'
2017-09-14 19:41:54,892 [salt.state       ][INFO    ][30630] {'vm.swappiness': 10}
2017-09-14 19:41:54,892 [salt.state       ][INFO    ][30630] Completed state [vm.swappiness] at time 19:41:54.892513 duration_in_ms=24.037
2017-09-14 19:41:54,893 [salt.state       ][INFO    ][30630] Running state [net.core.netdev_max_backlog] at time 19:41:54.893034
2017-09-14 19:41:54,893 [salt.state       ][INFO    ][30630] Executing state sysctl.present for net.core.netdev_max_backlog
2017-09-14 19:41:54,894 [salt.loaded.int.module.cmdmod][INFO    ][30630] Executing command 'sysctl -a' in directory '/root'
2017-09-14 19:41:54,909 [salt.loaded.int.module.cmdmod][INFO    ][30630] Executing command 'sysctl -w net.core.netdev_max_backlog="261144"' in directory '/root'
2017-09-14 19:41:54,916 [salt.state       ][INFO    ][30630] {'net.core.netdev_max_backlog': 261144}
2017-09-14 19:41:54,917 [salt.state       ][INFO    ][30630] Completed state [net.core.netdev_max_backlog] at time 19:41:54.917351 duration_in_ms=24.317
2017-09-14 19:41:54,917 [salt.state       ][INFO    ][30630] Running state [net.ipv4.neigh.default.gc_thresh1] at time 19:41:54.917804
2017-09-14 19:41:54,918 [salt.state       ][INFO    ][30630] Executing state sysctl.present for net.ipv4.neigh.default.gc_thresh1
2017-09-14 19:41:54,918 [salt.loaded.int.module.cmdmod][INFO    ][30630] Executing command 'sysctl -a' in directory '/root'
2017-09-14 19:41:54,934 [salt.loaded.int.module.cmdmod][INFO    ][30630] Executing command 'sysctl -w net.ipv4.neigh.default.gc_thresh1="4096"' in directory '/root'
2017-09-14 19:41:54,941 [salt.state       ][INFO    ][30630] {'net.ipv4.neigh.default.gc_thresh1': 4096}
2017-09-14 19:41:54,941 [salt.state       ][INFO    ][30630] Completed state [net.ipv4.neigh.default.gc_thresh1] at time 19:41:54.941488 duration_in_ms=23.684
2017-09-14 19:41:54,941 [salt.state       ][INFO    ][30630] Running state [net.ipv4.neigh.default.gc_thresh2] at time 19:41:54.941940
2017-09-14 19:41:54,942 [salt.state       ][INFO    ][30630] Executing state sysctl.present for net.ipv4.neigh.default.gc_thresh2
2017-09-14 19:41:54,943 [salt.loaded.int.module.cmdmod][INFO    ][30630] Executing command 'sysctl -a' in directory '/root'
2017-09-14 19:41:54,958 [salt.loaded.int.module.cmdmod][INFO    ][30630] Executing command 'sysctl -w net.ipv4.neigh.default.gc_thresh2="8192"' in directory '/root'
2017-09-14 19:41:54,965 [salt.state       ][INFO    ][30630] {'net.ipv4.neigh.default.gc_thresh2': 8192}
2017-09-14 19:41:54,965 [salt.state       ][INFO    ][30630] Completed state [net.ipv4.neigh.default.gc_thresh2] at time 19:41:54.965673 duration_in_ms=23.733
2017-09-14 19:41:54,966 [salt.state       ][INFO    ][30630] Running state [net.ipv4.neigh.default.gc_thresh3] at time 19:41:54.966113
2017-09-14 19:41:54,966 [salt.state       ][INFO    ][30630] Executing state sysctl.present for net.ipv4.neigh.default.gc_thresh3
2017-09-14 19:41:54,967 [salt.loaded.int.module.cmdmod][INFO    ][30630] Executing command 'sysctl -a' in directory '/root'
2017-09-14 19:41:54,982 [salt.loaded.int.module.cmdmod][INFO    ][30630] Executing command 'sysctl -w net.ipv4.neigh.default.gc_thresh3="16384"' in directory '/root'
2017-09-14 19:41:54,989 [salt.state       ][INFO    ][30630] {'net.ipv4.neigh.default.gc_thresh3': 16384}
2017-09-14 19:41:54,989 [salt.state       ][INFO    ][30630] Completed state [net.ipv4.neigh.default.gc_thresh3] at time 19:41:54.989725 duration_in_ms=23.612
2017-09-14 19:41:54,990 [salt.state       ][INFO    ][30630] Running state [net.ipv4.tcp_fin_timeout] at time 19:41:54.990164
2017-09-14 19:41:54,990 [salt.state       ][INFO    ][30630] Executing state sysctl.present for net.ipv4.tcp_fin_timeout
2017-09-14 19:41:54,991 [salt.loaded.int.module.cmdmod][INFO    ][30630] Executing command 'sysctl -a' in directory '/root'
2017-09-14 19:41:55,006 [salt.loaded.int.module.cmdmod][INFO    ][30630] Executing command 'sysctl -w net.ipv4.tcp_fin_timeout="30"' in directory '/root'
2017-09-14 19:41:55,013 [salt.state       ][INFO    ][30630] {'net.ipv4.tcp_fin_timeout': 30}
2017-09-14 19:41:55,014 [salt.state       ][INFO    ][30630] Completed state [net.ipv4.tcp_fin_timeout] at time 19:41:55.014241 duration_in_ms=24.077
2017-09-14 19:41:55,014 [salt.state       ][INFO    ][30630] Running state [net.ipv4.tcp_keepalive_time] at time 19:41:55.014680
2017-09-14 19:41:55,015 [salt.state       ][INFO    ][30630] Executing state sysctl.present for net.ipv4.tcp_keepalive_time
2017-09-14 19:41:55,015 [salt.loaded.int.module.cmdmod][INFO    ][30630] Executing command 'sysctl -a' in directory '/root'
2017-09-14 19:41:55,031 [salt.loaded.int.module.cmdmod][INFO    ][30630] Executing command 'sysctl -w net.ipv4.tcp_keepalive_time="30"' in directory '/root'
2017-09-14 19:41:55,039 [salt.state       ][INFO    ][30630] {'net.ipv4.tcp_keepalive_time': 30}
2017-09-14 19:41:55,039 [salt.state       ][INFO    ][30630] Completed state [net.ipv4.tcp_keepalive_time] at time 19:41:55.039782 duration_in_ms=25.102
2017-09-14 19:41:55,040 [salt.state       ][INFO    ][30630] Running state [kernel.panic] at time 19:41:55.040217
2017-09-14 19:41:55,040 [salt.state       ][INFO    ][30630] Executing state sysctl.present for kernel.panic
2017-09-14 19:41:55,041 [salt.loaded.int.module.cmdmod][INFO    ][30630] Executing command 'sysctl -a' in directory '/root'
2017-09-14 19:41:55,057 [salt.loaded.int.module.cmdmod][INFO    ][30630] Executing command 'sysctl -w kernel.panic="60"' in directory '/root'
2017-09-14 19:41:55,064 [salt.state       ][INFO    ][30630] {'kernel.panic': 60}
2017-09-14 19:41:55,064 [salt.state       ][INFO    ][30630] Completed state [kernel.panic] at time 19:41:55.064533 duration_in_ms=24.316
2017-09-14 19:41:55,067 [salt.state       ][INFO    ][30630] Running state [linux_sysfs_package] at time 19:41:55.067624
2017-09-14 19:41:55,068 [salt.state       ][INFO    ][30630] Executing state pkg.installed for linux_sysfs_package
2017-09-14 19:41:55,315 [salt.loaded.int.module.cmdmod][INFO    ][30630] Executing command ['apt-cache', '-q', 'policy', 'sysfsutils'] in directory '/root'
2017-09-14 19:41:55,353 [salt.loaded.int.module.cmdmod][INFO    ][30630] Executing command ['apt-get', '-q', 'update'] in directory '/root'
2017-09-14 19:41:57,287 [salt.loaded.int.module.cmdmod][INFO    ][30630] Executing command ['dpkg', '--get-selections', '*'] in directory '/root'
2017-09-14 19:41:57,307 [salt.loaded.int.module.cmdmod][INFO    ][30630] Executing command ['systemd-run', '--scope', 'apt-get', '-q', '-y', '-o', 'DPkg::Options::=--force-confold', '-o', 'DPkg::Options::=--force-confdef', 'install', 'sysfsutils'] in directory '/root'
2017-09-14 19:41:58,113 [salt.minion      ][INFO    ][30118] User sudo_ubuntu Executing command saltutil.find_job with jid 20170914194158097399
2017-09-14 19:41:58,137 [salt.minion      ][INFO    ][884] Starting a new job with PID 884
2017-09-14 19:41:58,171 [salt.minion      ][INFO    ][884] Returning information for job: 20170914194158097399
2017-09-14 19:42:03,220 [salt.loaded.int.module.cmdmod][INFO    ][30630] Executing command ['dpkg-query', '--showformat', '${Status} ${Package} ${Version} ${Architecture}\n', '-W'] in directory '/root'
2017-09-14 19:42:03,270 [salt.state       ][INFO    ][30630] Made the following changes:
'libsysfs2' changed from 'absent' to '2.1.0+repack-4'
'sysfsutils' changed from 'absent' to '2.1.0+repack-4'

2017-09-14 19:42:03,286 [salt.state       ][INFO    ][30630] Loading fresh modules for state activity
2017-09-14 19:42:03,318 [salt.state       ][INFO    ][30630] Completed state [linux_sysfs_package] at time 19:42:03.318211 duration_in_ms=8250.585
2017-09-14 19:42:03,322 [salt.state       ][INFO    ][30630] Running state [/etc/sysfs.d] at time 19:42:03.322273
2017-09-14 19:42:03,322 [salt.state       ][INFO    ][30630] Executing state file.directory for /etc/sysfs.d
2017-09-14 19:42:03,326 [salt.state       ][INFO    ][30630] Directory /etc/sysfs.d is in the correct state
2017-09-14 19:42:03,326 [salt.state       ][INFO    ][30630] Completed state [/etc/sysfs.d] at time 19:42:03.326821 duration_in_ms=4.548
2017-09-14 19:42:03,429 [salt.state       ][INFO    ][30630] Running state [ondemand] at time 19:42:03.429225
2017-09-14 19:42:03,429 [salt.state       ][INFO    ][30630] Executing state service.dead for ondemand
2017-09-14 19:42:03,431 [salt.loaded.int.module.cmdmod][INFO    ][30630] Executing command ['systemctl', 'status', 'ondemand.service', '-n', '0'] in directory '/root'
2017-09-14 19:42:03,440 [salt.loaded.int.module.cmdmod][INFO    ][30630] Executing command ['systemctl', 'is-active', 'ondemand.service'] in directory '/root'
2017-09-14 19:42:03,449 [salt.loaded.int.module.cmdmod][INFO    ][30630] Executing command ['systemctl', 'is-enabled', 'ondemand.service'] in directory '/root'
2017-09-14 19:42:03,458 [salt.loaded.int.module.cmdmod][INFO    ][30630] Executing command ['systemd-run', '--scope', 'systemctl', 'stop', 'ondemand.service'] in directory '/root'
2017-09-14 19:42:03,498 [salt.loaded.int.module.cmdmod][INFO    ][30630] Executing command ['systemctl', 'is-active', 'ondemand.service'] in directory '/root'
2017-09-14 19:42:03,507 [salt.loaded.int.module.cmdmod][INFO    ][30630] Executing command ['systemctl', 'is-enabled', 'ondemand.service'] in directory '/root'
2017-09-14 19:42:03,515 [salt.loaded.int.module.cmdmod][INFO    ][30630] Executing command ['systemctl', 'is-enabled', 'ondemand.service'] in directory '/root'
2017-09-14 19:42:03,524 [salt.loaded.int.module.cmdmod][INFO    ][30630] Executing command ['systemd-run', '--scope', '/usr/sbin/update-rc.d', '-f', 'ondemand', 'remove'] in directory '/root'
2017-09-14 19:42:03,626 [salt.loaded.int.module.cmdmod][INFO    ][30630] Executing command ['systemctl', 'is-enabled', 'ondemand.service'] in directory '/root'
2017-09-14 19:42:03,638 [salt.loaded.int.module.cmdmod][INFO    ][30630] Executing command 'runlevel' in directory '/root'
2017-09-14 19:42:03,643 [salt.state       ][INFO    ][30630] {'ondemand': True}
2017-09-14 19:42:03,644 [salt.state       ][INFO    ][30630] Completed state [ondemand] at time 19:42:03.643983 duration_in_ms=214.758
2017-09-14 19:42:03,644 [salt.state       ][INFO    ][30630] Running state [cs_CZ.UTF-8] at time 19:42:03.644706
2017-09-14 19:42:03,645 [salt.state       ][INFO    ][30630] Executing state locale.present for cs_CZ.UTF-8
2017-09-14 19:42:03,645 [salt.loaded.int.module.cmdmod][INFO    ][30630] Executing command 'locale -a' in directory '/root'
2017-09-14 19:42:03,653 [salt.loaded.int.module.cmdmod][INFO    ][30630] Executing command ['locale-gen', 'cs_CZ.utf8'] in directory '/root'
2017-09-14 19:42:04,292 [salt.state       ][INFO    ][30630] {'locale': 'cs_CZ.UTF-8'}
2017-09-14 19:42:04,293 [salt.state       ][INFO    ][30630] Completed state [cs_CZ.UTF-8] at time 19:42:04.293792 duration_in_ms=649.085
2017-09-14 19:42:04,294 [salt.state       ][INFO    ][30630] Running state [en_US.UTF-8] at time 19:42:04.294803
2017-09-14 19:42:04,295 [salt.state       ][INFO    ][30630] Executing state locale.present for en_US.UTF-8
2017-09-14 19:42:04,297 [salt.loaded.int.module.cmdmod][INFO    ][30630] Executing command 'locale -a' in directory '/root'
2017-09-14 19:42:04,308 [salt.state       ][INFO    ][30630] Locale en_US.UTF-8 is already present
2017-09-14 19:42:04,309 [salt.state       ][INFO    ][30630] Completed state [en_US.UTF-8] at time 19:42:04.309665 duration_in_ms=14.862
2017-09-14 19:42:04,312 [salt.state       ][INFO    ][30630] Running state [en_US.UTF-8] at time 19:42:04.312085
2017-09-14 19:42:04,312 [salt.state       ][INFO    ][30630] Executing state locale.system for en_US.UTF-8
2017-09-14 19:42:04,314 [salt.loaded.int.module.cmdmod][INFO    ][30630] Executing command 'localectl' in directory '/root'
2017-09-14 19:42:04,421 [salt.state       ][INFO    ][30630] System locale en_US.UTF-8 already set
2017-09-14 19:42:04,422 [salt.state       ][INFO    ][30630] Completed state [en_US.UTF-8] at time 19:42:04.422019 duration_in_ms=109.932
2017-09-14 19:42:04,424 [salt.state       ][INFO    ][30630] Running state [salt] at time 19:42:04.424656
2017-09-14 19:42:04,425 [salt.state       ][INFO    ][30630] Executing state user.present for salt
2017-09-14 19:42:04,427 [salt.state       ][INFO    ][30630] User salt is present and up to date
2017-09-14 19:42:04,428 [salt.state       ][INFO    ][30630] Completed state [salt] at time 19:42:04.428563 duration_in_ms=3.907
2017-09-14 19:42:04,430 [salt.state       ][INFO    ][30630] Running state [/var/tmp/salt] at time 19:42:04.430657
2017-09-14 19:42:04,431 [salt.state       ][INFO    ][30630] Executing state file.directory for /var/tmp/salt
2017-09-14 19:42:04,432 [salt.state       ][INFO    ][30630] Directory /var/tmp/salt is in the correct state
2017-09-14 19:42:04,433 [salt.state       ][INFO    ][30630] Completed state [/var/tmp/salt] at time 19:42:04.433489 duration_in_ms=2.832
2017-09-14 19:42:04,434 [salt.state       ][INFO    ][30630] Running state [/etc/sudoers.d/90-salt-user-salt] at time 19:42:04.434198
2017-09-14 19:42:04,434 [salt.state       ][INFO    ][30630] Executing state file.absent for /etc/sudoers.d/90-salt-user-salt
2017-09-14 19:42:04,435 [salt.state       ][INFO    ][30630] File /etc/sudoers.d/90-salt-user-salt is not present
2017-09-14 19:42:04,436 [salt.state       ][INFO    ][30630] Completed state [/etc/sudoers.d/90-salt-user-salt] at time 19:42:04.436323 duration_in_ms=2.125
2017-09-14 19:42:04,437 [salt.state       ][INFO    ][30630] Running state [root] at time 19:42:04.437096
2017-09-14 19:42:04,437 [salt.state       ][INFO    ][30630] Executing state user.present for root
2017-09-14 19:42:04,439 [salt.state       ][INFO    ][30630] User root is present and up to date
2017-09-14 19:42:04,440 [salt.state       ][INFO    ][30630] Completed state [root] at time 19:42:04.439994 duration_in_ms=2.897
2017-09-14 19:42:04,441 [salt.state       ][INFO    ][30630] Running state [/root] at time 19:42:04.441709
2017-09-14 19:42:04,442 [salt.state       ][INFO    ][30630] Executing state file.directory for /root
2017-09-14 19:42:04,443 [salt.state       ][INFO    ][30630] Directory /root is in the correct state
2017-09-14 19:42:04,444 [salt.state       ][INFO    ][30630] Completed state [/root] at time 19:42:04.444125 duration_in_ms=2.416
2017-09-14 19:42:04,444 [salt.state       ][INFO    ][30630] Running state [/etc/sudoers.d/90-salt-user-root] at time 19:42:04.444766
2017-09-14 19:42:04,445 [salt.state       ][INFO    ][30630] Executing state file.absent for /etc/sudoers.d/90-salt-user-root
2017-09-14 19:42:04,446 [salt.state       ][INFO    ][30630] File /etc/sudoers.d/90-salt-user-root is not present
2017-09-14 19:42:04,446 [salt.state       ][INFO    ][30630] Completed state [/etc/sudoers.d/90-salt-user-root] at time 19:42:04.446845 duration_in_ms=2.078
2017-09-14 19:42:04,447 [salt.state       ][INFO    ][30630] Running state [ubuntu] at time 19:42:04.447508
2017-09-14 19:42:04,448 [salt.state       ][INFO    ][30630] Executing state user.present for ubuntu
2017-09-14 19:42:04,449 [salt.state       ][INFO    ][30630] User ubuntu is present and up to date
2017-09-14 19:42:04,450 [salt.state       ][INFO    ][30630] Completed state [ubuntu] at time 19:42:04.450368 duration_in_ms=2.86
2017-09-14 19:42:04,452 [salt.state       ][INFO    ][30630] Running state [/home/ubuntu] at time 19:42:04.451983
2017-09-14 19:42:04,452 [salt.state       ][INFO    ][30630] Executing state file.directory for /home/ubuntu
2017-09-14 19:42:04,453 [salt.state       ][INFO    ][30630] Directory /home/ubuntu is in the correct state
2017-09-14 19:42:04,454 [salt.state       ][INFO    ][30630] Completed state [/home/ubuntu] at time 19:42:04.454425 duration_in_ms=2.442
2017-09-14 19:42:04,455 [salt.state       ][INFO    ][30630] Running state [/etc/sudoers.d/90-salt-user-ubuntu] at time 19:42:04.455814
2017-09-14 19:42:04,456 [salt.state       ][INFO    ][30630] Executing state file.managed for /etc/sudoers.d/90-salt-user-ubuntu
2017-09-14 19:42:04,476 [salt.state       ][INFO    ][30630] File /etc/sudoers.d/90-salt-user-ubuntu is in the correct state
2017-09-14 19:42:04,477 [salt.state       ][INFO    ][30630] Completed state [/etc/sudoers.d/90-salt-user-ubuntu] at time 19:42:04.477489 duration_in_ms=21.676
2017-09-14 19:42:04,478 [salt.state       ][INFO    ][30630] Running state [/etc/security/limits.d/90-salt-default.conf] at time 19:42:04.478111
2017-09-14 19:42:04,478 [salt.state       ][INFO    ][30630] Executing state file.managed for /etc/security/limits.d/90-salt-default.conf
2017-09-14 19:42:04,495 [salt.fileclient  ][INFO    ][30630] Fetching file from saltenv 'base', ** done ** 'linux/files/limits.conf'
2017-09-14 19:42:04,561 [salt.state       ][INFO    ][30630] File changed:
New file
2017-09-14 19:42:04,562 [salt.state       ][INFO    ][30630] Completed state [/etc/security/limits.d/90-salt-default.conf] at time 19:42:04.562457 duration_in_ms=84.347
2017-09-14 19:42:04,562 [salt.state       ][INFO    ][30630] Running state [/etc/systemd/system.conf.d/90-salt.conf] at time 19:42:04.562900
2017-09-14 19:42:04,563 [salt.state       ][INFO    ][30630] Executing state file.managed for /etc/systemd/system.conf.d/90-salt.conf
2017-09-14 19:42:04,578 [salt.fileclient  ][INFO    ][30630] Fetching file from saltenv 'base', ** done ** 'linux/files/systemd.conf'
2017-09-14 19:42:04,633 [salt.state       ][INFO    ][30630] File changed:
New file
2017-09-14 19:42:04,633 [salt.state       ][INFO    ][30630] Completed state [/etc/systemd/system.conf.d/90-salt.conf] at time 19:42:04.633782 duration_in_ms=70.882
2017-09-14 19:42:04,635 [salt.state       ][INFO    ][30630] Running state [service.systemctl_reload] at time 19:42:04.635083
2017-09-14 19:42:04,635 [salt.state       ][INFO    ][30630] Executing state module.wait for service.systemctl_reload
2017-09-14 19:42:04,635 [salt.state       ][INFO    ][30630] No changes made for service.systemctl_reload
2017-09-14 19:42:04,636 [salt.state       ][INFO    ][30630] Completed state [service.systemctl_reload] at time 19:42:04.636216 duration_in_ms=1.134
2017-09-14 19:42:04,636 [salt.state       ][INFO    ][30630] Running state [service.systemctl_reload] at time 19:42:04.636556
2017-09-14 19:42:04,636 [salt.state       ][INFO    ][30630] Executing state module.mod_watch for service.systemctl_reload
2017-09-14 19:42:04,637 [salt.loaded.int.module.cmdmod][INFO    ][30630] Executing command ['systemctl', '--system', 'daemon-reload'] in directory '/root'
2017-09-14 19:42:04,722 [salt.state       ][INFO    ][30630] {'ret': True}
2017-09-14 19:42:04,723 [salt.state       ][INFO    ][30630] Completed state [service.systemctl_reload] at time 19:42:04.722976 duration_in_ms=86.419
2017-09-14 19:42:04,723 [salt.state       ][INFO    ][30630] Running state [/etc/hostname] at time 19:42:04.723336
2017-09-14 19:42:04,723 [salt.state       ][INFO    ][30630] Executing state file.managed for /etc/hostname
2017-09-14 19:42:04,740 [salt.fileclient  ][INFO    ][30630] Fetching file from saltenv 'base', ** done ** 'linux/files/hostname'
2017-09-14 19:42:04,743 [salt.state       ][INFO    ][30630] File /etc/hostname is in the correct state
2017-09-14 19:42:04,743 [salt.state       ][INFO    ][30630] Completed state [/etc/hostname] at time 19:42:04.743562 duration_in_ms=20.226
2017-09-14 19:42:04,745 [salt.state       ][INFO    ][30630] Running state [hostname cfg01] at time 19:42:04.745690
2017-09-14 19:42:04,746 [salt.state       ][INFO    ][30630] Executing state cmd.wait for hostname cfg01
2017-09-14 19:42:04,746 [salt.state       ][INFO    ][30630] No changes made for hostname cfg01
2017-09-14 19:42:04,746 [salt.state       ][INFO    ][30630] Completed state [hostname cfg01] at time 19:42:04.746928 duration_in_ms=1.238
2017-09-14 19:42:04,747 [salt.state       ][INFO    ][30630] Running state [mdb02.baremetal-mcp-ocata-odl-ha.local] at time 19:42:04.747606
2017-09-14 19:42:04,748 [salt.state       ][INFO    ][30630] Executing state host.present for mdb02.baremetal-mcp-ocata-odl-ha.local
2017-09-14 19:42:04,750 [salt.state       ][INFO    ][30630] {'host': 'mdb02.baremetal-mcp-ocata-odl-ha.local'}
2017-09-14 19:42:04,750 [salt.state       ][INFO    ][30630] Completed state [mdb02.baremetal-mcp-ocata-odl-ha.local] at time 19:42:04.750539 duration_in_ms=2.933
2017-09-14 19:42:04,750 [salt.state       ][INFO    ][30630] Running state [mdb02] at time 19:42:04.750949
2017-09-14 19:42:04,751 [salt.state       ][INFO    ][30630] Executing state host.present for mdb02
2017-09-14 19:42:04,752 [salt.state       ][INFO    ][30630] {'host': 'mdb02'}
2017-09-14 19:42:04,753 [salt.state       ][INFO    ][30630] Completed state [mdb02] at time 19:42:04.753109 duration_in_ms=2.16
2017-09-14 19:42:04,753 [salt.state       ][INFO    ][30630] Running state [mdb03.baremetal-mcp-ocata-odl-ha.local] at time 19:42:04.753496
2017-09-14 19:42:04,753 [salt.state       ][INFO    ][30630] Executing state host.present for mdb03.baremetal-mcp-ocata-odl-ha.local
2017-09-14 19:42:04,758 [salt.state       ][INFO    ][30630] {'host': 'mdb03.baremetal-mcp-ocata-odl-ha.local'}
2017-09-14 19:42:04,759 [salt.state       ][INFO    ][30630] Completed state [mdb03.baremetal-mcp-ocata-odl-ha.local] at time 19:42:04.759194 duration_in_ms=5.698
2017-09-14 19:42:04,759 [salt.state       ][INFO    ][30630] Running state [mdb03] at time 19:42:04.759592
2017-09-14 19:42:04,760 [salt.state       ][INFO    ][30630] Executing state host.present for mdb03
2017-09-14 19:42:04,764 [salt.state       ][INFO    ][30630] {'host': 'mdb03'}
2017-09-14 19:42:04,765 [salt.state       ][INFO    ][30630] Completed state [mdb03] at time 19:42:04.765230 duration_in_ms=5.638
2017-09-14 19:42:04,765 [salt.state       ][INFO    ][30630] Running state [mdb01.baremetal-mcp-ocata-odl-ha.local] at time 19:42:04.765674
2017-09-14 19:42:04,766 [salt.state       ][INFO    ][30630] Executing state host.present for mdb01.baremetal-mcp-ocata-odl-ha.local
2017-09-14 19:42:04,768 [salt.state       ][INFO    ][30630] {'host': 'mdb01.baremetal-mcp-ocata-odl-ha.local'}
2017-09-14 19:42:04,768 [salt.state       ][INFO    ][30630] Completed state [mdb01.baremetal-mcp-ocata-odl-ha.local] at time 19:42:04.768681 duration_in_ms=3.007
2017-09-14 19:42:04,769 [salt.state       ][INFO    ][30630] Running state [mdb01] at time 19:42:04.769136
2017-09-14 19:42:04,769 [salt.state       ][INFO    ][30630] Executing state host.present for mdb01
2017-09-14 19:42:04,774 [salt.state       ][INFO    ][30630] {'host': 'mdb01'}
2017-09-14 19:42:04,774 [salt.state       ][INFO    ][30630] Completed state [mdb01] at time 19:42:04.774755 duration_in_ms=5.619
2017-09-14 19:42:04,775 [salt.state       ][INFO    ][30630] Running state [mdb] at time 19:42:04.775197
2017-09-14 19:42:04,775 [salt.state       ][INFO    ][30630] Executing state host.present for mdb
2017-09-14 19:42:04,780 [salt.state       ][INFO    ][30630] {'host': 'mdb'}
2017-09-14 19:42:04,780 [salt.state       ][INFO    ][30630] Completed state [mdb] at time 19:42:04.780714 duration_in_ms=5.517
2017-09-14 19:42:04,781 [salt.state       ][INFO    ][30630] Running state [mdb.baremetal-mcp-ocata-odl-ha.local] at time 19:42:04.781194
2017-09-14 19:42:04,781 [salt.state       ][INFO    ][30630] Executing state host.present for mdb.baremetal-mcp-ocata-odl-ha.local
2017-09-14 19:42:04,786 [salt.state       ][INFO    ][30630] {'host': 'mdb.baremetal-mcp-ocata-odl-ha.local'}
2017-09-14 19:42:04,786 [salt.state       ][INFO    ][30630] Completed state [mdb.baremetal-mcp-ocata-odl-ha.local] at time 19:42:04.786799 duration_in_ms=5.605
2017-09-14 19:42:04,787 [salt.state       ][INFO    ][30630] Running state [cfg01.baremetal-mcp-ocata-odl-ha.local] at time 19:42:04.787222
2017-09-14 19:42:04,787 [salt.state       ][INFO    ][30630] Executing state host.present for cfg01.baremetal-mcp-ocata-odl-ha.local
2017-09-14 19:42:04,792 [salt.state       ][INFO    ][30630] {'host': 'cfg01.baremetal-mcp-ocata-odl-ha.local'}
2017-09-14 19:42:04,793 [salt.state       ][INFO    ][30630] Completed state [cfg01.baremetal-mcp-ocata-odl-ha.local] at time 19:42:04.792952 duration_in_ms=5.73
2017-09-14 19:42:04,793 [salt.state       ][INFO    ][30630] Running state [cfg01] at time 19:42:04.793378
2017-09-14 19:42:04,793 [salt.state       ][INFO    ][30630] Executing state host.present for cfg01
2017-09-14 19:42:04,798 [salt.state       ][INFO    ][30630] {'host': 'cfg01'}
2017-09-14 19:42:04,798 [salt.state       ][INFO    ][30630] Completed state [cfg01] at time 19:42:04.798922 duration_in_ms=5.545
2017-09-14 19:42:04,799 [salt.state       ][INFO    ][30630] Running state [prx01] at time 19:42:04.799364
2017-09-14 19:42:04,799 [salt.state       ][INFO    ][30630] Executing state host.present for prx01
2017-09-14 19:42:04,804 [salt.state       ][INFO    ][30630] {'host': 'prx01'}
2017-09-14 19:42:04,805 [salt.state       ][INFO    ][30630] Completed state [prx01] at time 19:42:04.805015 duration_in_ms=5.651
2017-09-14 19:42:04,805 [salt.state       ][INFO    ][30630] Running state [prx01.baremetal-mcp-ocata-odl-ha.local] at time 19:42:04.805458
2017-09-14 19:42:04,805 [salt.state       ][INFO    ][30630] Executing state host.present for prx01.baremetal-mcp-ocata-odl-ha.local
2017-09-14 19:42:04,810 [salt.state       ][INFO    ][30630] {'host': 'prx01.baremetal-mcp-ocata-odl-ha.local'}
2017-09-14 19:42:04,810 [salt.state       ][INFO    ][30630] Completed state [prx01.baremetal-mcp-ocata-odl-ha.local] at time 19:42:04.810877 duration_in_ms=5.419
2017-09-14 19:42:04,811 [salt.state       ][INFO    ][30630] Running state [kvm01.baremetal-mcp-ocata-odl-ha.local] at time 19:42:04.811356
2017-09-14 19:42:04,811 [salt.state       ][INFO    ][30630] Executing state host.present for kvm01.baremetal-mcp-ocata-odl-ha.local
2017-09-14 19:42:04,816 [salt.state       ][INFO    ][30630] {'host': 'kvm01.baremetal-mcp-ocata-odl-ha.local'}
2017-09-14 19:42:04,817 [salt.state       ][INFO    ][30630] Completed state [kvm01.baremetal-mcp-ocata-odl-ha.local] at time 19:42:04.816950 duration_in_ms=5.595
2017-09-14 19:42:04,817 [salt.state       ][INFO    ][30630] Running state [kvm01] at time 19:42:04.817410
2017-09-14 19:42:04,817 [salt.state       ][INFO    ][30630] Executing state host.present for kvm01
2017-09-14 19:42:04,822 [salt.state       ][INFO    ][30630] {'host': 'kvm01'}
2017-09-14 19:42:04,822 [salt.state       ][INFO    ][30630] Completed state [kvm01] at time 19:42:04.822938 duration_in_ms=5.527
2017-09-14 19:42:04,823 [salt.state       ][INFO    ][30630] Running state [kvm03.baremetal-mcp-ocata-odl-ha.local] at time 19:42:04.823396
2017-09-14 19:42:04,823 [salt.state       ][INFO    ][30630] Executing state host.present for kvm03.baremetal-mcp-ocata-odl-ha.local
2017-09-14 19:42:04,828 [salt.state       ][INFO    ][30630] {'host': 'kvm03.baremetal-mcp-ocata-odl-ha.local'}
2017-09-14 19:42:04,829 [salt.state       ][INFO    ][30630] Completed state [kvm03.baremetal-mcp-ocata-odl-ha.local] at time 19:42:04.828974 duration_in_ms=5.578
2017-09-14 19:42:04,829 [salt.state       ][INFO    ][30630] Running state [kvm03] at time 19:42:04.829459
2017-09-14 19:42:04,831 [salt.state       ][INFO    ][30630] Executing state host.present for kvm03
2017-09-14 19:42:04,834 [salt.state       ][INFO    ][30630] {'host': 'kvm03'}
2017-09-14 19:42:04,835 [salt.state       ][INFO    ][30630] Completed state [kvm03] at time 19:42:04.835009 duration_in_ms=5.549
2017-09-14 19:42:04,835 [salt.state       ][INFO    ][30630] Running state [kvm02.baremetal-mcp-ocata-odl-ha.local] at time 19:42:04.835478
2017-09-14 19:42:04,835 [salt.state       ][INFO    ][30630] Executing state host.present for kvm02.baremetal-mcp-ocata-odl-ha.local
2017-09-14 19:42:04,840 [salt.state       ][INFO    ][30630] {'host': 'kvm02.baremetal-mcp-ocata-odl-ha.local'}
2017-09-14 19:42:04,841 [salt.state       ][INFO    ][30630] Completed state [kvm02.baremetal-mcp-ocata-odl-ha.local] at time 19:42:04.841336 duration_in_ms=5.858
2017-09-14 19:42:04,841 [salt.state       ][INFO    ][30630] Running state [kvm02] at time 19:42:04.841830
2017-09-14 19:42:04,842 [salt.state       ][INFO    ][30630] Executing state host.present for kvm02
2017-09-14 19:42:04,846 [salt.state       ][INFO    ][30630] {'host': 'kvm02'}
2017-09-14 19:42:04,847 [salt.state       ][INFO    ][30630] Completed state [kvm02] at time 19:42:04.847107 duration_in_ms=5.276
2017-09-14 19:42:04,847 [salt.state       ][INFO    ][30630] Running state [dbs] at time 19:42:04.847590
2017-09-14 19:42:04,848 [salt.state       ][INFO    ][30630] Executing state host.present for dbs
2017-09-14 19:42:04,852 [salt.state       ][INFO    ][30630] {'host': 'dbs'}
2017-09-14 19:42:04,853 [salt.state       ][INFO    ][30630] Completed state [dbs] at time 19:42:04.853008 duration_in_ms=5.418
2017-09-14 19:42:04,853 [salt.state       ][INFO    ][30630] Running state [dbs.baremetal-mcp-ocata-odl-ha.local] at time 19:42:04.853491
2017-09-14 19:42:04,853 [salt.state       ][INFO    ][30630] Executing state host.present for dbs.baremetal-mcp-ocata-odl-ha.local
2017-09-14 19:42:04,858 [salt.state       ][INFO    ][30630] {'host': 'dbs.baremetal-mcp-ocata-odl-ha.local'}
2017-09-14 19:42:04,859 [salt.state       ][INFO    ][30630] Completed state [dbs.baremetal-mcp-ocata-odl-ha.local] at time 19:42:04.859028 duration_in_ms=5.536
2017-09-14 19:42:04,859 [salt.state       ][INFO    ][30630] Running state [prx.baremetal-mcp-ocata-odl-ha.local] at time 19:42:04.859510
2017-09-14 19:42:04,860 [salt.state       ][INFO    ][30630] Executing state host.present for prx.baremetal-mcp-ocata-odl-ha.local
2017-09-14 19:42:04,861 [salt.state       ][INFO    ][30630] {'host': 'prx.baremetal-mcp-ocata-odl-ha.local'}
2017-09-14 19:42:04,861 [salt.state       ][INFO    ][30630] Completed state [prx.baremetal-mcp-ocata-odl-ha.local] at time 19:42:04.861671 duration_in_ms=2.16
2017-09-14 19:42:04,862 [salt.state       ][INFO    ][30630] Running state [prx] at time 19:42:04.862167
2017-09-14 19:42:04,862 [salt.state       ][INFO    ][30630] Executing state host.present for prx
2017-09-14 19:42:04,866 [salt.state       ][INFO    ][30630] {'host': 'prx'}
2017-09-14 19:42:04,867 [salt.state       ][INFO    ][30630] Completed state [prx] at time 19:42:04.866956 duration_in_ms=4.788
2017-09-14 19:42:04,867 [salt.state       ][INFO    ][30630] Running state [prx02] at time 19:42:04.867431
2017-09-14 19:42:04,867 [salt.state       ][INFO    ][30630] Executing state host.present for prx02
2017-09-14 19:42:04,872 [salt.state       ][INFO    ][30630] {'host': 'prx02'}
2017-09-14 19:42:04,873 [salt.state       ][INFO    ][30630] Completed state [prx02] at time 19:42:04.873033 duration_in_ms=5.601
2017-09-14 19:42:04,873 [salt.state       ][INFO    ][30630] Running state [prx02.baremetal-mcp-ocata-odl-ha.local] at time 19:42:04.873512
2017-09-14 19:42:04,874 [salt.state       ][INFO    ][30630] Executing state host.present for prx02.baremetal-mcp-ocata-odl-ha.local
2017-09-14 19:42:04,878 [salt.state       ][INFO    ][30630] {'host': 'prx02.baremetal-mcp-ocata-odl-ha.local'}
2017-09-14 19:42:04,879 [salt.state       ][INFO    ][30630] Completed state [prx02.baremetal-mcp-ocata-odl-ha.local] at time 19:42:04.879007 duration_in_ms=5.495
2017-09-14 19:42:04,879 [salt.state       ][INFO    ][30630] Running state [msg02.baremetal-mcp-ocata-odl-ha.local] at time 19:42:04.879500
2017-09-14 19:42:04,880 [salt.state       ][INFO    ][30630] Executing state host.present for msg02.baremetal-mcp-ocata-odl-ha.local
2017-09-14 19:42:04,884 [salt.state       ][INFO    ][30630] {'host': 'msg02.baremetal-mcp-ocata-odl-ha.local'}
2017-09-14 19:42:04,885 [salt.state       ][INFO    ][30630] Completed state [msg02.baremetal-mcp-ocata-odl-ha.local] at time 19:42:04.885120 duration_in_ms=5.621
2017-09-14 19:42:04,885 [salt.state       ][INFO    ][30630] Running state [msg02] at time 19:42:04.885623
2017-09-14 19:42:04,886 [salt.state       ][INFO    ][30630] Executing state host.present for msg02
2017-09-14 19:42:04,890 [salt.state       ][INFO    ][30630] {'host': 'msg02'}
2017-09-14 19:42:04,891 [salt.state       ][INFO    ][30630] Completed state [msg02] at time 19:42:04.891045 duration_in_ms=5.423
2017-09-14 19:42:04,891 [salt.state       ][INFO    ][30630] Running state [msg03.baremetal-mcp-ocata-odl-ha.local] at time 19:42:04.891540
2017-09-14 19:42:04,892 [salt.state       ][INFO    ][30630] Executing state host.present for msg03.baremetal-mcp-ocata-odl-ha.local
2017-09-14 19:42:04,896 [salt.state       ][INFO    ][30630] {'host': 'msg03.baremetal-mcp-ocata-odl-ha.local'}
2017-09-14 19:42:04,897 [salt.state       ][INFO    ][30630] Completed state [msg03.baremetal-mcp-ocata-odl-ha.local] at time 19:42:04.897087 duration_in_ms=5.547
2017-09-14 19:42:04,897 [salt.state       ][INFO    ][30630] Running state [msg03] at time 19:42:04.897589
2017-09-14 19:42:04,898 [salt.state       ][INFO    ][30630] Executing state host.present for msg03
2017-09-14 19:42:04,902 [salt.state       ][INFO    ][30630] {'host': 'msg03'}
2017-09-14 19:42:04,903 [salt.state       ][INFO    ][30630] Completed state [msg03] at time 19:42:04.903084 duration_in_ms=5.494
2017-09-14 19:42:04,903 [salt.state       ][INFO    ][30630] Running state [msg01.baremetal-mcp-ocata-odl-ha.local] at time 19:42:04.903574
2017-09-14 19:42:04,904 [salt.state       ][INFO    ][30630] Executing state host.present for msg01.baremetal-mcp-ocata-odl-ha.local
2017-09-14 19:42:04,908 [salt.state       ][INFO    ][30630] {'host': 'msg01.baremetal-mcp-ocata-odl-ha.local'}
2017-09-14 19:42:04,909 [salt.state       ][INFO    ][30630] Completed state [msg01.baremetal-mcp-ocata-odl-ha.local] at time 19:42:04.909129 duration_in_ms=5.556
2017-09-14 19:42:04,909 [salt.state       ][INFO    ][30630] Running state [msg01] at time 19:42:04.909637
2017-09-14 19:42:04,910 [salt.state       ][INFO    ][30630] Executing state host.present for msg01
2017-09-14 19:42:04,914 [salt.state       ][INFO    ][30630] {'host': 'msg01'}
2017-09-14 19:42:04,915 [salt.state       ][INFO    ][30630] Completed state [msg01] at time 19:42:04.915134 duration_in_ms=5.497
2017-09-14 19:42:04,915 [salt.state       ][INFO    ][30630] Running state [msg] at time 19:42:04.915629
2017-09-14 19:42:04,916 [salt.state       ][INFO    ][30630] Executing state host.present for msg
2017-09-14 19:42:04,920 [salt.state       ][INFO    ][30630] {'host': 'msg'}
2017-09-14 19:42:04,921 [salt.state       ][INFO    ][30630] Completed state [msg] at time 19:42:04.921171 duration_in_ms=5.543
2017-09-14 19:42:04,921 [salt.state       ][INFO    ][30630] Running state [msg.baremetal-mcp-ocata-odl-ha.local] at time 19:42:04.921662
2017-09-14 19:42:04,922 [salt.state       ][INFO    ][30630] Executing state host.present for msg.baremetal-mcp-ocata-odl-ha.local
2017-09-14 19:42:04,926 [salt.state       ][INFO    ][30630] {'host': 'msg.baremetal-mcp-ocata-odl-ha.local'}
2017-09-14 19:42:04,927 [salt.state       ][INFO    ][30630] Completed state [msg.baremetal-mcp-ocata-odl-ha.local] at time 19:42:04.927270 duration_in_ms=5.607
2017-09-14 19:42:04,927 [salt.state       ][INFO    ][30630] Running state [cfg01.baremetal-mcp-ocata-odl-ha.local] at time 19:42:04.927805
2017-09-14 19:42:04,928 [salt.state       ][INFO    ][30630] Executing state host.present for cfg01.baremetal-mcp-ocata-odl-ha.local
2017-09-14 19:42:04,929 [salt.state       ][INFO    ][30630] Host cfg01.baremetal-mcp-ocata-odl-ha.local (10.167.4.100) already present
2017-09-14 19:42:04,929 [salt.state       ][INFO    ][30630] Completed state [cfg01.baremetal-mcp-ocata-odl-ha.local] at time 19:42:04.929554 duration_in_ms=1.748
2017-09-14 19:42:04,930 [salt.state       ][INFO    ][30630] Running state [cfg01] at time 19:42:04.930072
2017-09-14 19:42:04,930 [salt.state       ][INFO    ][30630] Executing state host.present for cfg01
2017-09-14 19:42:04,931 [salt.state       ][INFO    ][30630] Host cfg01 (10.167.4.100) already present
2017-09-14 19:42:04,931 [salt.state       ][INFO    ][30630] Completed state [cfg01] at time 19:42:04.931758 duration_in_ms=1.686
2017-09-14 19:42:04,932 [salt.state       ][INFO    ][30630] Running state [cmp002] at time 19:42:04.932277
2017-09-14 19:42:04,932 [salt.state       ][INFO    ][30630] Executing state host.present for cmp002
2017-09-14 19:42:04,934 [salt.state       ][INFO    ][30630] {'host': 'cmp002'}
2017-09-14 19:42:04,934 [salt.state       ][INFO    ][30630] Completed state [cmp002] at time 19:42:04.934626 duration_in_ms=2.349
2017-09-14 19:42:04,935 [salt.state       ][INFO    ][30630] Running state [cmp002.baremetal-mcp-ocata-odl-ha.local] at time 19:42:04.935145
2017-09-14 19:42:04,935 [salt.state       ][INFO    ][30630] Executing state host.present for cmp002.baremetal-mcp-ocata-odl-ha.local
2017-09-14 19:42:04,938 [salt.state       ][INFO    ][30630] {'host': 'cmp002.baremetal-mcp-ocata-odl-ha.local'}
2017-09-14 19:42:04,939 [salt.state       ][INFO    ][30630] Completed state [cmp002.baremetal-mcp-ocata-odl-ha.local] at time 19:42:04.939173 duration_in_ms=4.029
2017-09-14 19:42:04,939 [salt.state       ][INFO    ][30630] Running state [cmp001] at time 19:42:04.939690
2017-09-14 19:42:04,940 [salt.state       ][INFO    ][30630] Executing state host.present for cmp001
2017-09-14 19:42:04,945 [salt.state       ][INFO    ][30630] {'host': 'cmp001'}
2017-09-14 19:42:04,946 [salt.state       ][INFO    ][30630] Completed state [cmp001] at time 19:42:04.946150 duration_in_ms=6.459
2017-09-14 19:42:04,946 [salt.state       ][INFO    ][30630] Running state [cmp001.baremetal-mcp-ocata-odl-ha.local] at time 19:42:04.946636
2017-09-14 19:42:04,947 [salt.state       ][INFO    ][30630] Executing state host.present for cmp001.baremetal-mcp-ocata-odl-ha.local
2017-09-14 19:42:04,950 [salt.state       ][INFO    ][30630] {'host': 'cmp001.baremetal-mcp-ocata-odl-ha.local'}
2017-09-14 19:42:04,951 [salt.state       ][INFO    ][30630] Completed state [cmp001.baremetal-mcp-ocata-odl-ha.local] at time 19:42:04.951093 duration_in_ms=4.457
2017-09-14 19:42:04,951 [salt.state       ][INFO    ][30630] Running state [dbs01.baremetal-mcp-ocata-odl-ha.local] at time 19:42:04.951586
2017-09-14 19:42:04,952 [salt.state       ][INFO    ][30630] Executing state host.present for dbs01.baremetal-mcp-ocata-odl-ha.local
2017-09-14 19:42:04,956 [salt.state       ][INFO    ][30630] {'host': 'dbs01.baremetal-mcp-ocata-odl-ha.local'}
2017-09-14 19:42:04,957 [salt.state       ][INFO    ][30630] Completed state [dbs01.baremetal-mcp-ocata-odl-ha.local] at time 19:42:04.957181 duration_in_ms=5.595
2017-09-14 19:42:04,957 [salt.state       ][INFO    ][30630] Running state [dbs01] at time 19:42:04.957636
2017-09-14 19:42:04,958 [salt.state       ][INFO    ][30630] Executing state host.present for dbs01
2017-09-14 19:42:04,962 [salt.state       ][INFO    ][30630] {'host': 'dbs01'}
2017-09-14 19:42:04,963 [salt.state       ][INFO    ][30630] Completed state [dbs01] at time 19:42:04.963134 duration_in_ms=5.498
2017-09-14 19:42:04,963 [salt.state       ][INFO    ][30630] Running state [dbs02.baremetal-mcp-ocata-odl-ha.local] at time 19:42:04.963583
2017-09-14 19:42:04,964 [salt.state       ][INFO    ][30630] Executing state host.present for dbs02.baremetal-mcp-ocata-odl-ha.local
2017-09-14 19:42:04,968 [salt.state       ][INFO    ][30630] {'host': 'dbs02.baremetal-mcp-ocata-odl-ha.local'}
2017-09-14 19:42:04,969 [salt.state       ][INFO    ][30630] Completed state [dbs02.baremetal-mcp-ocata-odl-ha.local] at time 19:42:04.969225 duration_in_ms=5.642
2017-09-14 19:42:04,969 [salt.state       ][INFO    ][30630] Running state [dbs02] at time 19:42:04.969709
2017-09-14 19:42:04,970 [salt.state       ][INFO    ][30630] Executing state host.present for dbs02
2017-09-14 19:42:04,974 [salt.state       ][INFO    ][30630] {'host': 'dbs02'}
2017-09-14 19:42:04,975 [salt.state       ][INFO    ][30630] Completed state [dbs02] at time 19:42:04.975159 duration_in_ms=5.45
2017-09-14 19:42:04,975 [salt.state       ][INFO    ][30630] Running state [dbs03.baremetal-mcp-ocata-odl-ha.local] at time 19:42:04.975614
2017-09-14 19:42:04,976 [salt.state       ][INFO    ][30630] Executing state host.present for dbs03.baremetal-mcp-ocata-odl-ha.local
2017-09-14 19:42:04,980 [salt.state       ][INFO    ][30630] {'host': 'dbs03.baremetal-mcp-ocata-odl-ha.local'}
2017-09-14 19:42:04,981 [salt.state       ][INFO    ][30630] Completed state [dbs03.baremetal-mcp-ocata-odl-ha.local] at time 19:42:04.981285 duration_in_ms=5.67
2017-09-14 19:42:04,981 [salt.state       ][INFO    ][30630] Running state [dbs03] at time 19:42:04.981733
2017-09-14 19:42:04,982 [salt.state       ][INFO    ][30630] Executing state host.present for dbs03
2017-09-14 19:42:04,992 [salt.state       ][INFO    ][30630] {'host': 'dbs03'}
2017-09-14 19:42:04,992 [salt.state       ][INFO    ][30630] Completed state [dbs03] at time 19:42:04.992505 duration_in_ms=10.771
2017-09-14 19:42:04,993 [salt.state       ][INFO    ][30630] Running state [odl01.baremetal-mcp-ocata-odl-ha.local] at time 19:42:04.993072
2017-09-14 19:42:04,993 [salt.state       ][INFO    ][30630] Executing state host.present for odl01.baremetal-mcp-ocata-odl-ha.local
2017-09-14 19:42:04,998 [salt.state       ][INFO    ][30630] {'host': 'odl01.baremetal-mcp-ocata-odl-ha.local'}
2017-09-14 19:42:04,998 [salt.state       ][INFO    ][30630] Completed state [odl01.baremetal-mcp-ocata-odl-ha.local] at time 19:42:04.998517 duration_in_ms=5.445
2017-09-14 19:42:04,999 [salt.state       ][INFO    ][30630] Running state [odl01] at time 19:42:04.999008
2017-09-14 19:42:04,999 [salt.state       ][INFO    ][30630] Executing state host.present for odl01
2017-09-14 19:42:05,004 [salt.state       ][INFO    ][30630] {'host': 'odl01'}
2017-09-14 19:42:05,004 [salt.state       ][INFO    ][30630] Completed state [odl01] at time 19:42:05.004570 duration_in_ms=5.56
2017-09-14 19:42:05,005 [salt.state       ][INFO    ][30630] Running state [mas01.baremetal-mcp-ocata-odl-ha.local] at time 19:42:05.005121
2017-09-14 19:42:05,005 [salt.state       ][INFO    ][30630] Executing state host.present for mas01.baremetal-mcp-ocata-odl-ha.local
2017-09-14 19:42:05,010 [salt.state       ][INFO    ][30630] {'host': 'mas01.baremetal-mcp-ocata-odl-ha.local'}
2017-09-14 19:42:05,010 [salt.state       ][INFO    ][30630] Completed state [mas01.baremetal-mcp-ocata-odl-ha.local] at time 19:42:05.010554 duration_in_ms=5.433
2017-09-14 19:42:05,011 [salt.state       ][INFO    ][30630] Running state [mas01] at time 19:42:05.011049
2017-09-14 19:42:05,011 [salt.state       ][INFO    ][30630] Executing state host.present for mas01
2017-09-14 19:42:05,016 [salt.state       ][INFO    ][30630] {'host': 'mas01'}
2017-09-14 19:42:05,016 [salt.state       ][INFO    ][30630] Completed state [mas01] at time 19:42:05.016550 duration_in_ms=5.5
2017-09-14 19:42:05,017 [salt.state       ][INFO    ][30630] Running state [ctl02.baremetal-mcp-ocata-odl-ha.local] at time 19:42:05.017110
2017-09-14 19:42:05,017 [salt.state       ][INFO    ][30630] Executing state host.present for ctl02.baremetal-mcp-ocata-odl-ha.local
2017-09-14 19:42:05,022 [salt.state       ][INFO    ][30630] {'host': 'ctl02.baremetal-mcp-ocata-odl-ha.local'}
2017-09-14 19:42:05,022 [salt.state       ][INFO    ][30630] Completed state [ctl02.baremetal-mcp-ocata-odl-ha.local] at time 19:42:05.022619 duration_in_ms=5.508
2017-09-14 19:42:05,023 [salt.state       ][INFO    ][30630] Running state [ctl02] at time 19:42:05.023119
2017-09-14 19:42:05,023 [salt.state       ][INFO    ][30630] Executing state host.present for ctl02
2017-09-14 19:42:05,059 [salt.state       ][INFO    ][30630] {'host': 'ctl02'}
2017-09-14 19:42:05,059 [salt.state       ][INFO    ][30630] Completed state [ctl02] at time 19:42:05.059726 duration_in_ms=36.606
2017-09-14 19:42:05,060 [salt.state       ][INFO    ][30630] Running state [ctl03.baremetal-mcp-ocata-odl-ha.local] at time 19:42:05.060242
2017-09-14 19:42:05,060 [salt.state       ][INFO    ][30630] Executing state host.present for ctl03.baremetal-mcp-ocata-odl-ha.local
2017-09-14 19:42:05,064 [salt.state       ][INFO    ][30630] {'host': 'ctl03.baremetal-mcp-ocata-odl-ha.local'}
2017-09-14 19:42:05,065 [salt.state       ][INFO    ][30630] Completed state [ctl03.baremetal-mcp-ocata-odl-ha.local] at time 19:42:05.065278 duration_in_ms=5.035
2017-09-14 19:42:05,066 [salt.state       ][INFO    ][30630] Running state [ctl03] at time 19:42:05.066035
2017-09-14 19:42:05,066 [salt.state       ][INFO    ][30630] Executing state host.present for ctl03
2017-09-14 19:42:05,070 [salt.state       ][INFO    ][30630] {'host': 'ctl03'}
2017-09-14 19:42:05,071 [salt.state       ][INFO    ][30630] Completed state [ctl03] at time 19:42:05.071310 duration_in_ms=5.274
2017-09-14 19:42:05,071 [salt.state       ][INFO    ][30630] Running state [ctl01.baremetal-mcp-ocata-odl-ha.local] at time 19:42:05.071766
2017-09-14 19:42:05,072 [salt.state       ][INFO    ][30630] Executing state host.present for ctl01.baremetal-mcp-ocata-odl-ha.local
2017-09-14 19:42:05,076 [salt.state       ][INFO    ][30630] {'host': 'ctl01.baremetal-mcp-ocata-odl-ha.local'}
2017-09-14 19:42:05,077 [salt.state       ][INFO    ][30630] Completed state [ctl01.baremetal-mcp-ocata-odl-ha.local] at time 19:42:05.077333 duration_in_ms=5.567
2017-09-14 19:42:05,077 [salt.state       ][INFO    ][30630] Running state [ctl01] at time 19:42:05.077808
2017-09-14 19:42:05,078 [salt.state       ][INFO    ][30630] Executing state host.present for ctl01
2017-09-14 19:42:05,082 [salt.state       ][INFO    ][30630] {'host': 'ctl01'}
2017-09-14 19:42:05,083 [salt.state       ][INFO    ][30630] Completed state [ctl01] at time 19:42:05.083290 duration_in_ms=5.481
2017-09-14 19:42:05,083 [salt.state       ][INFO    ][30630] Running state [ctl] at time 19:42:05.083745
2017-09-14 19:42:05,084 [salt.state       ][INFO    ][30630] Executing state host.present for ctl
2017-09-14 19:42:05,089 [salt.state       ][INFO    ][30630] {'host': 'ctl'}
2017-09-14 19:42:05,089 [salt.state       ][INFO    ][30630] Completed state [ctl] at time 19:42:05.089373 duration_in_ms=5.628
2017-09-14 19:42:05,089 [salt.state       ][INFO    ][30630] Running state [ctl.baremetal-mcp-ocata-odl-ha.local] at time 19:42:05.089845
2017-09-14 19:42:05,090 [salt.state       ][INFO    ][30630] Executing state host.present for ctl.baremetal-mcp-ocata-odl-ha.local
2017-09-14 19:42:05,094 [salt.state       ][INFO    ][30630] {'host': 'ctl.baremetal-mcp-ocata-odl-ha.local'}
2017-09-14 19:42:05,095 [salt.state       ][INFO    ][30630] Completed state [ctl.baremetal-mcp-ocata-odl-ha.local] at time 19:42:05.095310 duration_in_ms=5.465
2017-09-14 19:42:05,096 [salt.state       ][INFO    ][30630] Running state [ens4] at time 19:42:05.096766
2017-09-14 19:42:05,097 [salt.state       ][INFO    ][30630] Executing state network.managed for ens4
2017-09-14 19:42:05,266 [salt.loaded.int.module.cmdmod][INFO    ][30630] Executing command ['ifup', 'ens4'] in directory '/root'
2017-09-14 19:42:05,815 [salt.state       ][INFO    ][30630] {'interface': 'Added network interface.', 'status': 'Interface ens4 is up'}
2017-09-14 19:42:05,816 [salt.state       ][INFO    ][30630] Completed state [ens4] at time 19:42:05.816767 duration_in_ms=720.0
2017-09-14 19:42:05,817 [salt.state       ][INFO    ][30630] Running state [ens3] at time 19:42:05.817473
2017-09-14 19:42:05,818 [salt.state       ][INFO    ][30630] Executing state network.managed for ens3
2017-09-14 19:42:06,167 [salt.state       ][INFO    ][30630] Interface ens3 is up to date.
2017-09-14 19:42:06,167 [salt.state       ][INFO    ][30630] Completed state [ens3] at time 19:42:06.167947 duration_in_ms=350.473
2017-09-14 19:42:06,168 [salt.state       ][INFO    ][30630] Running state [/etc/profile.d/proxy.sh] at time 19:42:06.168314
2017-09-14 19:42:06,168 [salt.state       ][INFO    ][30630] Executing state file.absent for /etc/profile.d/proxy.sh
2017-09-14 19:42:06,169 [salt.state       ][INFO    ][30630] File /etc/profile.d/proxy.sh is not present
2017-09-14 19:42:06,169 [salt.state       ][INFO    ][30630] Completed state [/etc/profile.d/proxy.sh] at time 19:42:06.169403 duration_in_ms=1.089
2017-09-14 19:42:06,169 [salt.state       ][INFO    ][30630] Running state [/etc/apt/apt.conf.d/95proxies] at time 19:42:06.169719
2017-09-14 19:42:06,170 [salt.state       ][INFO    ][30630] Executing state file.absent for /etc/apt/apt.conf.d/95proxies
2017-09-14 19:42:06,170 [salt.state       ][INFO    ][30630] File /etc/apt/apt.conf.d/95proxies is not present
2017-09-14 19:42:06,170 [salt.state       ][INFO    ][30630] Completed state [/etc/apt/apt.conf.d/95proxies] at time 19:42:06.170692 duration_in_ms=0.973
2017-09-14 19:42:06,172 [salt.minion      ][INFO    ][30630] Returning information for job: 20170914194127750869
2017-09-14 19:42:50,524 [salt.minion      ][INFO    ][30118] User sudo_ubuntu Executing command state.sls with jid 20170914194250513578
2017-09-14 19:42:50,541 [salt.minion      ][INFO    ][1666] Starting a new job with PID 1666
2017-09-14 19:42:52,337 [salt.state       ][INFO    ][1666] Loading fresh modules for state activity
2017-09-14 19:42:52,367 [salt.fileclient  ][INFO    ][1666] Fetching file from saltenv 'base', ** done ** 'ntp/init.sls'
2017-09-14 19:42:52,384 [salt.fileclient  ][INFO    ][1666] Fetching file from saltenv 'base', ** done ** 'ntp/client.sls'
2017-09-14 19:42:52,398 [salt.fileclient  ][INFO    ][1666] Fetching file from saltenv 'base', ** done ** 'ntp/map.jinja'
2017-09-14 19:42:52,419 [salt.fileclient  ][INFO    ][1666] Fetching file from saltenv 'base', ** done ** 'ntp/server.sls'
2017-09-14 19:42:52,820 [salt.state       ][INFO    ][1666] Running state [ntp] at time 19:42:52.820667
2017-09-14 19:42:52,821 [salt.state       ][INFO    ][1666] Executing state pkg.installed for ntp
2017-09-14 19:42:52,822 [salt.loaded.int.module.cmdmod][INFO    ][1666] Executing command ['dpkg-query', '--showformat', '${Status} ${Package} ${Version} ${Architecture}\n', '-W'] in directory '/root'
2017-09-14 19:42:53,242 [salt.loaded.int.module.cmdmod][INFO    ][1666] Executing command ['apt-get', '-q', 'update'] in directory '/root'
2017-09-14 19:42:55,209 [salt.loaded.int.module.cmdmod][INFO    ][1666] Executing command ['dpkg', '--get-selections', '*'] in directory '/root'
2017-09-14 19:42:55,229 [salt.loaded.int.module.cmdmod][INFO    ][1666] Executing command ['systemd-run', '--scope', 'apt-get', '-q', '-y', '-o', 'DPkg::Options::=--force-confold', '-o', 'DPkg::Options::=--force-confdef', 'install', 'ntp'] in directory '/root'
2017-09-14 19:43:00,630 [salt.minion      ][INFO    ][30118] User sudo_ubuntu Executing command saltutil.find_job with jid 20170914194300617239
2017-09-14 19:43:00,661 [salt.minion      ][INFO    ][2658] Starting a new job with PID 2658
2017-09-14 19:43:00,690 [salt.minion      ][INFO    ][2658] Returning information for job: 20170914194300617239
2017-09-14 19:43:04,775 [salt.loaded.int.module.cmdmod][INFO    ][1666] Executing command ['dpkg-query', '--showformat', '${Status} ${Package} ${Version} ${Architecture}\n', '-W'] in directory '/root'
2017-09-14 19:43:04,812 [salt.state       ][INFO    ][1666] Made the following changes:
'ntp' changed from 'absent' to '1:4.2.8p4+dfsg-3ubuntu5.6'
'libopts25' changed from 'absent' to '1:5.18.7-3'

2017-09-14 19:43:04,824 [salt.state       ][INFO    ][1666] Loading fresh modules for state activity
2017-09-14 19:43:04,845 [salt.state       ][INFO    ][1666] Completed state [ntp] at time 19:43:04.845712 duration_in_ms=12025.045
2017-09-14 19:43:04,850 [salt.state       ][INFO    ][1666] Running state [/etc/ntp.conf] at time 19:43:04.850782
2017-09-14 19:43:04,851 [salt.state       ][INFO    ][1666] Executing state file.managed for /etc/ntp.conf
2017-09-14 19:43:04,879 [salt.fileclient  ][INFO    ][1666] Fetching file from saltenv 'base', ** done ** 'ntp/files/ntp.conf'
2017-09-14 19:43:04,925 [salt.state       ][INFO    ][1666] File changed:
--- 
+++ 
@@ -1,66 +1,24 @@
-# /etc/ntp.conf, configuration for ntpd; see ntp.conf(5) for help
 
-driftfile /var/lib/ntp/ntp.drift
 
-# Enable this if you want statistics to be logged.
-#statsdir /var/log/ntpstats/
+# ntpd will only synchronize your clock.
 
-statistics loopstats peerstats clockstats
-filegen loopstats file loopstats type day enable
-filegen peerstats file peerstats type day enable
-filegen clockstats file clockstats type day enable
+# For details, see:
+# - the ntp.conf man page
+# - http://support.ntp.org/bin/view/Support/GettingStarted
+# - https://wiki.archlinux.org/index.php/Network_Time_Protocol_daemon
 
-# Specify one or more NTP servers.
+# Associate to cloud NTP pool servers
+server 1.pool.ntp.org iburst
+server 0.pool.ntp.org
 
-# Use servers from the NTP Pool Project. Approved by Ubuntu Technical Board
-# on 2011-02-08 (LP: #104525). See http://www.pool.ntp.org/join.html for
-# more information.
-pool 0.ubuntu.pool.ntp.org iburst
-pool 1.ubuntu.pool.ntp.org iburst
-pool 2.ubuntu.pool.ntp.org iburst
-pool 3.ubuntu.pool.ntp.org iburst
-
-# Use Ubuntu's ntp server as a fallback.
-pool ntp.ubuntu.com
-
-# Access control configuration; see /usr/share/doc/ntp-doc/html/accopt.html for
-# details.  The web page <http://support.ntp.org/bin/view/Support/AccessRestrictions>
-# might also be helpful.
-#
-# Note that "restrict" applies to both servers and clients, so a configuration
-# that might be intended to block requests from certain clients could also end
-# up blocking replies from your own upstream servers.
-
-# By default, exchange time with everybody, but don't allow configuration.
-restrict -4 default kod notrap nomodify nopeer noquery limited
-restrict -6 default kod notrap nomodify nopeer noquery limited
-
-# Local users may interrogate the ntp server more closely.
+# Only allow read-only access from localhost
+restrict default noquery nopeer
 restrict 127.0.0.1
 restrict ::1
 
-# Needed for adding pool entries
-restrict source notrap nomodify noquery
-
-# Clients from this (example!) subnet have unlimited access, but only if
-# cryptographically authenticated.
-#restrict 192.168.123.0 mask 255.255.255.0 notrust
+# mode7 is required for collectd monitoring
 
 
-# If you want to provide time to your local subnet, change the next line.
-# (Again, the address is an example only.)
-#broadcast 192.168.123.255
-
-# If you want to listen to time broadcasts on your local subnet, de-comment the
-# next lines.  Please do this only if you trust everybody on the network!
-#disable auth
-#broadcastclient
-
-#Changes recquired to use pps synchonisation as explained in documentation:
-#http://www.ntp.org/ntpfaq/NTP-s-config-adv.htm#AEN3918
-
-#server 127.127.8.1 mode 135 prefer    # Meinberg GPS167 with PPS
-#fudge 127.127.8.1 time1 0.0042        # relative to PPS for my hardware
-
-#server 127.127.22.1                   # ATOM(PPS)
-#fudge 127.127.22.1 flag3 1            # enable PPS API
+# Location of drift file
+driftfile /var/lib/ntp/ntp.drift
+logfile /var/log/ntp.log
2017-09-14 19:43:04,925 [salt.state       ][INFO    ][1666] Completed state [/etc/ntp.conf] at time 19:43:04.925454 duration_in_ms=74.672
2017-09-14 19:43:05,026 [salt.state       ][INFO    ][1666] Running state [ntp] at time 19:43:05.026621
2017-09-14 19:43:05,027 [salt.state       ][INFO    ][1666] Executing state service.running for ntp
2017-09-14 19:43:05,030 [salt.loaded.int.module.cmdmod][INFO    ][1666] Executing command ['systemctl', 'status', 'ntp.service', '-n', '0'] in directory '/root'
2017-09-14 19:43:05,041 [salt.loaded.int.module.cmdmod][INFO    ][1666] Executing command ['systemctl', 'is-active', 'ntp.service'] in directory '/root'
2017-09-14 19:43:05,048 [salt.loaded.int.module.cmdmod][INFO    ][1666] Executing command ['systemctl', 'is-enabled', 'ntp.service'] in directory '/root'
2017-09-14 19:43:05,057 [salt.state       ][INFO    ][1666] The service ntp is already running
2017-09-14 19:43:05,057 [salt.state       ][INFO    ][1666] Completed state [ntp] at time 19:43:05.057777 duration_in_ms=31.156
2017-09-14 19:43:05,058 [salt.state       ][INFO    ][1666] Running state [ntp] at time 19:43:05.058133
2017-09-14 19:43:05,058 [salt.state       ][INFO    ][1666] Executing state service.mod_watch for ntp
2017-09-14 19:43:05,059 [salt.loaded.int.module.cmdmod][INFO    ][1666] Executing command ['systemctl', 'is-active', 'ntp.service'] in directory '/root'
2017-09-14 19:43:05,067 [salt.loaded.int.module.cmdmod][INFO    ][1666] Executing command ['systemctl', 'is-enabled', 'ntp.service'] in directory '/root'
2017-09-14 19:43:05,076 [salt.loaded.int.module.cmdmod][INFO    ][1666] Executing command ['systemd-run', '--scope', 'systemctl', 'restart', 'ntp.service'] in directory '/root'
2017-09-14 19:43:05,145 [salt.state       ][INFO    ][1666] {'ntp': True}
2017-09-14 19:43:05,145 [salt.state       ][INFO    ][1666] Completed state [ntp] at time 19:43:05.145926 duration_in_ms=87.791
2017-09-14 19:43:05,147 [salt.minion      ][INFO    ][1666] Returning information for job: 20170914194250513578
2017-09-14 19:45:11,368 [salt.minion      ][INFO    ][30118] User sudo_ubuntu Executing command state.apply with jid 20170914194511359634
2017-09-14 19:45:11,387 [salt.minion      ][INFO    ][3216] Starting a new job with PID 3216
2017-09-14 19:45:12,707 [salt.state       ][INFO    ][3216] Loading fresh modules for state activity
2017-09-14 19:45:12,728 [salt.fileclient  ][INFO    ][3216] Fetching file from saltenv 'base', ** done ** 'maas/pxe_route.sls'
2017-09-14 19:45:12,739 [salt.state       ][INFO    ][3216] Running state [ens3] at time 19:45:12.738990
2017-09-14 19:45:12,739 [salt.state       ][INFO    ][3216] Executing state network.routes for ens3
2017-09-14 19:45:12,850 [salt.loaded.int.module.cmdmod][INFO    ][3216] Executing command ['systemctl', 'status', 'networking.service', '-n', '0'] in directory '/root'
2017-09-14 19:45:12,867 [salt.loaded.int.module.cmdmod][INFO    ][3216] Executing command ['systemd-run', '--scope', 'systemctl', 'stop', 'networking.service'] in directory '/root'
2017-09-14 19:45:16,096 [salt.loaded.int.module.cmdmod][INFO    ][3216] Executing command ['systemctl', 'is-enabled', 'networking.service'] in directory '/root'
2017-09-14 19:45:16,113 [salt.loaded.int.module.cmdmod][INFO    ][3216] Executing command ['systemd-run', '--scope', 'systemctl', 'start', 'networking.service'] in directory '/root'
2017-09-14 19:45:16,436 [salt.loaded.int.module.cmdmod][ERROR   ][3216] Command '['systemd-run', '--scope', 'systemctl', 'start', 'networking.service']' failed with return code: 1
2017-09-14 19:45:16,437 [salt.loaded.int.module.cmdmod][ERROR   ][3216] output: Running scope as unit run-rf390f613a14c4eaf874907668d35fb44.scope.
Job for networking.service failed because the control process exited with error code. See "systemctl status networking.service" and "journalctl -xe" for details.
2017-09-14 19:45:16,438 [salt.state       ][INFO    ][3216] {'network_routes': 'Added interface ens3 routes.'}
2017-09-14 19:45:16,438 [salt.state       ][INFO    ][3216] Completed state [ens3] at time 19:45:16.438445 duration_in_ms=3699.454
2017-09-14 19:45:16,440 [salt.minion      ][INFO    ][3216] Returning information for job: 20170914194511359634
2017-09-14 20:40:48,701 [salt.utils.schedule][INFO    ][30118] Running scheduled job: __mine_interval
2017-09-14 21:16:50,036 [salt.minion      ][INFO    ][30118] User root Executing command x509.sign_remote_certificate with jid 20170914211650025039
2017-09-14 21:16:50,054 [salt.minion      ][INFO    ][13954] Starting a new job with PID 13954
2017-09-14 21:16:50,083 [salt.minion      ][INFO    ][13954] Returning information for job: 20170914211650025039
2017-09-14 21:16:50,401 [salt.minion      ][INFO    ][30118] User root Executing command x509.sign_remote_certificate with jid 20170914211650389762
2017-09-14 21:16:50,417 [salt.minion      ][INFO    ][13963] Starting a new job with PID 13963
2017-09-14 21:16:50,467 [salt.minion      ][INFO    ][13963] Returning information for job: 20170914211650389762
2017-09-14 21:16:52,214 [salt.minion      ][INFO    ][30118] User root Executing command x509.sign_remote_certificate with jid 20170914211652201779
2017-09-14 21:16:52,231 [salt.minion      ][INFO    ][14001] Starting a new job with PID 14001
2017-09-14 21:16:52,260 [salt.minion      ][INFO    ][14001] Returning information for job: 20170914211652201779
2017-09-14 21:16:52,585 [salt.minion      ][INFO    ][30118] User root Executing command x509.sign_remote_certificate with jid 20170914211652573818
2017-09-14 21:16:52,603 [salt.minion      ][INFO    ][14010] Starting a new job with PID 14010
2017-09-14 21:16:52,632 [salt.minion      ][INFO    ][14010] Returning information for job: 20170914211652573818
2017-09-14 21:40:48,701 [salt.utils.schedule][INFO    ][30118] Running scheduled job: __mine_interval
2017-09-14 22:40:48,701 [salt.utils.schedule][INFO    ][30118] Running scheduled job: __mine_interval
2017-09-14 22:40:49,124 [salt.minion      ][INFO    ][30118] User sudo_ubuntu Executing command cp.push_dir with jid 20170914224049113087
2017-09-14 22:40:49,145 [salt.minion      ][INFO    ][19817] Starting a new job with PID 19817
