2018-01-25 07:29:03,987 [salt.utils       ][ERROR   ][1301] DNS lookup or connection check of 'salt' failed.
2018-01-25 07:29:03,988 [salt.minion      ][ERROR   ][1301] Master hostname: 'salt' not found or not responsive. Retrying in 30 seconds
2018-01-25 07:29:04,328 [salt.utils.parsers][WARNING ][1301] Minion received a SIGTERM. Exiting.
2018-01-25 07:29:45,798 [salt.minion      ][ERROR   ][1558] Error while bringing up minion for multi-master. Is master at 10.20.0.2 responding?
2018-01-25 07:30:15,014 [salt.crypt       ][ERROR   ][1558] The Salt Master has cached the public key for this node, this salt minion will wait for 10 seconds before attempting to re-authenticate
2018-01-25 07:32:53,909 [salt.utils.parsers][WARNING ][13679] Minion received a SIGTERM. Exiting.
2018-01-25 07:33:16,238 [py.warnings      ][WARNING ][21085] /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.

2018-01-25 07:33:53,037 [salt.loaded.int.states.file][WARNING ][21085] 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.
2018-01-25 07:34:02,371 [salt.loaded.int.module.cmdmod][ERROR   ][21085] 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
2018-01-25 07:34:06,196 [salt.loaded.int.module.cmdmod][INFO    ][27331] Executing command ['systemctl', 'status', 'salt-minion.service', '-n', '0'] in directory '/root'
2018-01-25 07:34:06,211 [salt.loaded.int.module.cmdmod][INFO    ][27331] Executing command ['systemctl', 'is-enabled', 'salt-minion.service'] in directory '/root'
2018-01-25 07:34:06,231 [salt.loaded.int.module.cmdmod][INFO    ][27331] Executing command ['systemd-run', '--scope', 'systemctl', 'restart', 'salt-minion.service'] in directory '/root'
2018-01-25 07:34:06,271 [salt.utils.parsers][WARNING ][20760] Minion received a SIGTERM. Exiting.
2018-01-25 07:34:06,789 [salt.cli.daemons ][INFO    ][27383] Setting up the Salt Minion "cfg01.baremetal-mcp-pike-odl-ha.local"
2018-01-25 07:34:06,915 [salt.cli.daemons ][INFO    ][27383] Starting up the Salt Minion
2018-01-25 07:34:06,916 [salt.utils.event ][INFO    ][27383] Starting pull socket on /var/run/salt/minion/minion_event_c34ff6f193_pull.ipc
2018-01-25 07:34:07,479 [salt.minion      ][INFO    ][27383] Creating minion process manager
2018-01-25 07:34:08,820 [salt.loader.10.20.0.2.int.module.cmdmod][INFO    ][27383] Executing command ['date', '+%z'] in directory '/root'
2018-01-25 07:34:08,840 [salt.utils.schedule][INFO    ][27383] Updating job settings for scheduled job: __mine_interval
2018-01-25 07:34:08,842 [salt.minion      ][INFO    ][27383] Added mine.update to scheduler
2018-01-25 07:34:08,848 [salt.minion      ][INFO    ][27383] Minion is starting as user 'root'
2018-01-25 07:34:08,881 [salt.minion      ][INFO    ][27383] Minion is ready to receive requests!
2018-01-25 07:34:09,883 [salt.utils.schedule][INFO    ][27383] Running scheduled job: __mine_interval
2018-01-25 07:34:17,283 [salt.minion      ][INFO    ][27383] User sudo_ubuntu Executing command saltutil.find_job with jid 20180125073417271859
2018-01-25 07:34:17,307 [salt.minion      ][INFO    ][27494] Starting a new job with PID 27494
2018-01-25 07:34:17,329 [salt.minion      ][INFO    ][27494] Returning information for job: 20180125073417271859
2018-01-25 07:34:28,067 [salt.minion      ][INFO    ][27383] User sudo_ubuntu Executing command state.apply with jid 20180125073428055333
2018-01-25 07:34:28,085 [salt.minion      ][INFO    ][27526] Starting a new job with PID 27526
2018-01-25 07:34:28,804 [salt.state       ][INFO    ][27526] Loading fresh modules for state activity
2018-01-25 07:34:30,245 [salt.loaded.int.module.cmdmod][INFO    ][27526] Executing command 'reclass --version' in directory '/root'
2018-01-25 07:34:32,281 [salt.loaded.int.module.cmdmod][INFO    ][27526] Executing command 'reclass --version' in directory '/root'
2018-01-25 07:34:32,582 [py.warnings      ][WARNING ][27526] /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.

2018-01-25 07:34:32,583 [salt.loaded.int.module.cmdmod][INFO    ][27526] Executing command 'salt-minion --version' in directory '/root'
2018-01-25 07:34:32,854 [salt.loaded.int.module.cmdmod][INFO    ][27526] Executing command 'salt --version' in directory '/root'
2018-01-25 07:34:33,155 [salt.loaded.int.module.cmdmod][INFO    ][27526] Executing command 'salt-minion --version' in directory '/root'
2018-01-25 07:34:33,410 [salt.loaded.int.module.cmdmod][INFO    ][27526] Executing command 'salt --version' in directory '/root'
2018-01-25 07:34:35,085 [salt.loaded.int.module.cmdmod][INFO    ][27526] Executing command 'reclass --version' in directory '/root'
2018-01-25 07:34:35,304 [salt.loaded.int.module.cmdmod][INFO    ][27526] Executing command 'reclass --version' in directory '/root'
2018-01-25 07:34:35,606 [salt.loaded.int.module.cmdmod][INFO    ][27526] Executing command 'salt-minion --version' in directory '/root'
2018-01-25 07:34:35,876 [salt.loaded.int.module.cmdmod][INFO    ][27526] Executing command 'salt --version' in directory '/root'
2018-01-25 07:34:36,206 [salt.loaded.int.module.cmdmod][INFO    ][27526] Executing command 'salt-minion --version' in directory '/root'
2018-01-25 07:34:36,476 [salt.loaded.int.module.cmdmod][INFO    ][27526] Executing command 'salt --version' in directory '/root'
2018-01-25 07:34:38,014 [salt.state       ][INFO    ][27526] Running state [salt-master] at time 07:34:38.014018
2018-01-25 07:34:38,014 [salt.state       ][INFO    ][27526] Executing state pkg.installed for salt-master
2018-01-25 07:34:38,015 [salt.loaded.int.module.cmdmod][INFO    ][27526] Executing command ['dpkg-query', '--showformat', '${Status} ${Package} ${Version} ${Architecture}\n', '-W'] in directory '/root'
2018-01-25 07:34:38,152 [salt.minion      ][INFO    ][27383] User sudo_ubuntu Executing command saltutil.find_job with jid 20180125073438140083
2018-01-25 07:34:38,203 [salt.minion      ][INFO    ][27641] Starting a new job with PID 27641
2018-01-25 07:34:38,223 [salt.minion      ][INFO    ][27641] Returning information for job: 20180125073438140083
2018-01-25 07:34:38,452 [salt.state       ][INFO    ][27526] All specified packages are already installed
2018-01-25 07:34:38,453 [salt.state       ][INFO    ][27526] Completed state [salt-master] at time 07:34:38.453307 duration_in_ms=439.289
2018-01-25 07:34:38,457 [salt.state       ][INFO    ][27526] Running state [/etc/salt/master.d/master.conf] at time 07:34:38.457788
2018-01-25 07:34:38,458 [salt.state       ][INFO    ][27526] Executing state file.managed for /etc/salt/master.d/master.conf
2018-01-25 07:34:38,694 [salt.state       ][INFO    ][27526] File /etc/salt/master.d/master.conf is in the correct state
2018-01-25 07:34:38,694 [salt.state       ][INFO    ][27526] Completed state [/etc/salt/master.d/master.conf] at time 07:34:38.694414 duration_in_ms=236.627
2018-01-25 07:34:38,695 [salt.state       ][INFO    ][27526] Running state [/etc/salt/master.d/_acl.conf] at time 07:34:38.695586
2018-01-25 07:34:38,696 [salt.state       ][INFO    ][27526] Executing state file.managed for /etc/salt/master.d/_acl.conf
2018-01-25 07:34:38,782 [salt.state       ][INFO    ][27526] File /etc/salt/master.d/_acl.conf is in the correct state
2018-01-25 07:34:38,783 [salt.state       ][INFO    ][27526] Completed state [/etc/salt/master.d/_acl.conf] at time 07:34:38.782998 duration_in_ms=87.412
2018-01-25 07:34:38,784 [salt.state       ][INFO    ][27526] Running state [/etc/salt/master.d/_peer.conf] at time 07:34:38.784353
2018-01-25 07:34:38,784 [salt.state       ][INFO    ][27526] Executing state file.managed for /etc/salt/master.d/_peer.conf
2018-01-25 07:34:38,866 [salt.state       ][INFO    ][27526] File /etc/salt/master.d/_peer.conf is in the correct state
2018-01-25 07:34:38,866 [salt.state       ][INFO    ][27526] Completed state [/etc/salt/master.d/_peer.conf] at time 07:34:38.866552 duration_in_ms=82.199
2018-01-25 07:34:38,869 [salt.state       ][INFO    ][27526] Running state [salt-master] at time 07:34:38.869719
2018-01-25 07:34:38,870 [salt.state       ][INFO    ][27526] Executing state service.running for salt-master
2018-01-25 07:34:38,871 [salt.loaded.int.module.cmdmod][INFO    ][27526] Executing command ['systemctl', 'status', 'salt-master.service', '-n', '0'] in directory '/root'
2018-01-25 07:34:39,743 [salt.loaded.int.module.cmdmod][INFO    ][27526] Executing command ['systemctl', 'is-active', 'salt-master.service'] in directory '/root'
2018-01-25 07:34:39,759 [salt.loaded.int.module.cmdmod][INFO    ][27526] Executing command ['systemctl', 'is-enabled', 'salt-master.service'] in directory '/root'
2018-01-25 07:34:39,775 [salt.state       ][INFO    ][27526] The service salt-master is already running
2018-01-25 07:34:39,775 [salt.state       ][INFO    ][27526] Completed state [salt-master] at time 07:34:39.775728 duration_in_ms=906.008
2018-01-25 07:34:39,776 [salt.state       ][INFO    ][27526] Running state [/srv/salt/env] at time 07:34:39.776370
2018-01-25 07:34:39,776 [salt.state       ][INFO    ][27526] Executing state file.directory for /srv/salt/env
2018-01-25 07:34:39,778 [salt.state       ][INFO    ][27526] Directory /srv/salt/env is in the correct state
2018-01-25 07:34:39,779 [salt.state       ][INFO    ][27526] Completed state [/srv/salt/env] at time 07:34:39.778975 duration_in_ms=2.605
2018-01-25 07:34:39,780 [salt.state       ][INFO    ][27526] Running state [root] at time 07:34:39.780917
2018-01-25 07:34:39,781 [salt.state       ][INFO    ][27526] Executing state user.present for root
2018-01-25 07:34:39,783 [salt.state       ][INFO    ][27526] User root is present and up to date
2018-01-25 07:34:39,783 [salt.state       ][INFO    ][27526] Completed state [root] at time 07:34:39.783746 duration_in_ms=2.829
2018-01-25 07:34:39,785 [salt.state       ][INFO    ][27526] Running state [/root] at time 07:34:39.785447
2018-01-25 07:34:39,785 [salt.state       ][INFO    ][27526] Executing state file.directory for /root
2018-01-25 07:34:39,786 [salt.state       ][INFO    ][27526] Directory /root is in the correct state
2018-01-25 07:34:39,787 [salt.state       ][INFO    ][27526] Completed state [/root] at time 07:34:39.787194 duration_in_ms=1.747
2018-01-25 07:34:39,787 [salt.state       ][INFO    ][27526] Running state [/etc/sudoers.d/90-salt-user-root] at time 07:34:39.787672
2018-01-25 07:34:39,788 [salt.state       ][INFO    ][27526] Executing state file.absent for /etc/sudoers.d/90-salt-user-root
2018-01-25 07:34:39,788 [salt.state       ][INFO    ][27526] File /etc/sudoers.d/90-salt-user-root is not present
2018-01-25 07:34:39,789 [salt.state       ][INFO    ][27526] Completed state [/etc/sudoers.d/90-salt-user-root] at time 07:34:39.789054 duration_in_ms=1.382
2018-01-25 07:34:39,789 [salt.state       ][INFO    ][27526] Running state [salt] at time 07:34:39.789797
2018-01-25 07:34:39,790 [salt.state       ][INFO    ][27526] Executing state user.present for salt
2018-01-25 07:34:39,791 [salt.state       ][INFO    ][27526] User salt is present and up to date
2018-01-25 07:34:39,791 [salt.state       ][INFO    ][27526] Completed state [salt] at time 07:34:39.791924 duration_in_ms=2.127
2018-01-25 07:34:39,793 [salt.state       ][INFO    ][27526] Running state [/var/tmp/salt] at time 07:34:39.793259
2018-01-25 07:34:39,794 [salt.state       ][INFO    ][27526] Executing state file.directory for /var/tmp/salt
2018-01-25 07:34:39,795 [salt.state       ][INFO    ][27526] Directory /var/tmp/salt is in the correct state
2018-01-25 07:34:39,795 [salt.state       ][INFO    ][27526] Completed state [/var/tmp/salt] at time 07:34:39.795450 duration_in_ms=2.19
2018-01-25 07:34:39,795 [salt.state       ][INFO    ][27526] Running state [/etc/sudoers.d/90-salt-user-salt] at time 07:34:39.795917
2018-01-25 07:34:39,796 [salt.state       ][INFO    ][27526] Executing state file.absent for /etc/sudoers.d/90-salt-user-salt
2018-01-25 07:34:39,796 [salt.state       ][INFO    ][27526] File /etc/sudoers.d/90-salt-user-salt is not present
2018-01-25 07:34:39,797 [salt.state       ][INFO    ][27526] Completed state [/etc/sudoers.d/90-salt-user-salt] at time 07:34:39.797233 duration_in_ms=1.316
2018-01-25 07:34:39,797 [salt.state       ][INFO    ][27526] Running state [ubuntu] at time 07:34:39.797689
2018-01-25 07:34:39,798 [salt.state       ][INFO    ][27526] Executing state user.present for ubuntu
2018-01-25 07:34:39,799 [salt.state       ][INFO    ][27526] User ubuntu is present and up to date
2018-01-25 07:34:39,800 [salt.state       ][INFO    ][27526] Completed state [ubuntu] at time 07:34:39.800144 duration_in_ms=2.455
2018-01-25 07:34:39,801 [salt.state       ][INFO    ][27526] Running state [/home/ubuntu] at time 07:34:39.801483
2018-01-25 07:34:39,801 [salt.state       ][INFO    ][27526] Executing state file.directory for /home/ubuntu
2018-01-25 07:34:39,802 [salt.state       ][INFO    ][27526] Directory /home/ubuntu is in the correct state
2018-01-25 07:34:39,803 [salt.state       ][INFO    ][27526] Completed state [/home/ubuntu] at time 07:34:39.803294 duration_in_ms=1.81
2018-01-25 07:34:39,804 [salt.state       ][INFO    ][27526] Running state [/etc/sudoers.d/90-salt-user-ubuntu] at time 07:34:39.804505
2018-01-25 07:34:39,804 [salt.state       ][INFO    ][27526] Executing state file.managed for /etc/sudoers.d/90-salt-user-ubuntu
2018-01-25 07:34:39,822 [salt.state       ][INFO    ][27526] File /etc/sudoers.d/90-salt-user-ubuntu is in the correct state
2018-01-25 07:34:39,823 [salt.state       ][INFO    ][27526] Completed state [/etc/sudoers.d/90-salt-user-ubuntu] at time 07:34:39.823341 duration_in_ms=18.835
2018-01-25 07:34:39,823 [salt.state       ][INFO    ][27526] Running state [git-core] at time 07:34:39.823860
2018-01-25 07:34:39,824 [salt.state       ][INFO    ][27526] Executing state pkg.installed for git-core
2018-01-25 07:34:39,832 [salt.state       ][INFO    ][27526] All specified packages are already installed
2018-01-25 07:34:39,832 [salt.state       ][INFO    ][27526] Completed state [git-core] at time 07:34:39.832916 duration_in_ms=9.055
2018-01-25 07:34:39,833 [salt.state       ][INFO    ][27526] Running state [/usr/share/salt-formulas/env/_modules] at time 07:34:39.833421
2018-01-25 07:34:39,833 [salt.state       ][INFO    ][27526] Executing state file.directory for /usr/share/salt-formulas/env/_modules
2018-01-25 07:34:39,834 [salt.state       ][INFO    ][27526] Directory /usr/share/salt-formulas/env/_modules is in the correct state
2018-01-25 07:34:39,835 [salt.state       ][INFO    ][27526] Completed state [/usr/share/salt-formulas/env/_modules] at time 07:34:39.835130 duration_in_ms=1.709
2018-01-25 07:34:39,835 [salt.state       ][INFO    ][27526] Running state [/usr/share/salt-formulas/env/_states] at time 07:34:39.835618
2018-01-25 07:34:39,836 [salt.state       ][INFO    ][27526] Executing state file.directory for /usr/share/salt-formulas/env/_states
2018-01-25 07:34:39,836 [salt.state       ][INFO    ][27526] Directory /usr/share/salt-formulas/env/_states is in the correct state
2018-01-25 07:34:39,837 [salt.state       ][INFO    ][27526] Completed state [/usr/share/salt-formulas/env/_states] at time 07:34:39.837609 duration_in_ms=1.992
2018-01-25 07:34:39,838 [salt.state       ][INFO    ][27526] Running state [/usr/share/salt-formulas/env/_grains] at time 07:34:39.838098
2018-01-25 07:34:39,838 [salt.state       ][INFO    ][27526] Executing state file.directory for /usr/share/salt-formulas/env/_grains
2018-01-25 07:34:39,839 [salt.state       ][INFO    ][27526] Directory /usr/share/salt-formulas/env/_grains is in the correct state
2018-01-25 07:34:39,839 [salt.state       ][INFO    ][27526] Completed state [/usr/share/salt-formulas/env/_grains] at time 07:34:39.839861 duration_in_ms=1.763
2018-01-25 07:34:39,840 [salt.state       ][INFO    ][27526] Running state [/usr/share/salt-formulas/env/_formulas] at time 07:34:39.840322
2018-01-25 07:34:39,840 [salt.state       ][INFO    ][27526] Executing state file.directory for /usr/share/salt-formulas/env/_formulas
2018-01-25 07:34:39,841 [salt.state       ][INFO    ][27526] Directory /usr/share/salt-formulas/env/_formulas is in the correct state
2018-01-25 07:34:39,842 [salt.state       ][INFO    ][27526] Completed state [/usr/share/salt-formulas/env/_formulas] at time 07:34:39.842063 duration_in_ms=1.741
2018-01-25 07:34:39,842 [salt.state       ][INFO    ][27526] Running state [/usr/share/salt-formulas/env/_engines] at time 07:34:39.842521
2018-01-25 07:34:39,842 [salt.state       ][INFO    ][27526] Executing state file.directory for /usr/share/salt-formulas/env/_engines
2018-01-25 07:34:39,843 [salt.state       ][INFO    ][27526] Directory /usr/share/salt-formulas/env/_engines is in the correct state
2018-01-25 07:34:39,844 [salt.state       ][INFO    ][27526] Completed state [/usr/share/salt-formulas/env/_engines] at time 07:34:39.844229 duration_in_ms=1.708
2018-01-25 07:34:39,844 [salt.state       ][INFO    ][27526] Running state [/usr/share/salt-formulas/env/_runners] at time 07:34:39.844754
2018-01-25 07:34:39,845 [salt.state       ][INFO    ][27526] Executing state file.directory for /usr/share/salt-formulas/env/_runners
2018-01-25 07:34:39,846 [salt.state       ][INFO    ][27526] Directory /usr/share/salt-formulas/env/_runners is in the correct state
2018-01-25 07:34:39,846 [salt.state       ][INFO    ][27526] Completed state [/usr/share/salt-formulas/env/_runners] at time 07:34:39.846441 duration_in_ms=1.687
2018-01-25 07:34:39,848 [salt.state       ][INFO    ][27526] Running state [/srv/salt/env/prd] at time 07:34:39.848290
2018-01-25 07:34:39,848 [salt.state       ][INFO    ][27526] Executing state file.symlink for /srv/salt/env/prd
2018-01-25 07:34:39,850 [salt.state       ][INFO    ][27526] Symlink /srv/salt/env/prd is present and owned by root:root
2018-01-25 07:34:39,851 [salt.state       ][INFO    ][27526] Completed state [/srv/salt/env/prd] at time 07:34:39.851013 duration_in_ms=2.723
2018-01-25 07:34:39,851 [salt.state       ][INFO    ][27526] Running state [salt_master_prd_pkg_formulas] at time 07:34:39.851510
2018-01-25 07:34:39,852 [salt.state       ][INFO    ][27526] Executing state pkg.latest for salt_master_prd_pkg_formulas
2018-01-25 07:34:39,864 [salt.loaded.int.module.cmdmod][INFO    ][27526] Executing command ['apt-cache', '-q', 'policy', 'salt-formula-maas'] in directory '/root'
2018-01-25 07:34:39,910 [salt.loaded.int.module.cmdmod][INFO    ][27526] Executing command ['apt-cache', '-q', 'policy', 'salt-formula-grafana'] in directory '/root'
2018-01-25 07:34:39,958 [salt.loaded.int.module.cmdmod][INFO    ][27526] Executing command ['apt-cache', '-q', 'policy', 'salt-formula-xtrabackup'] in directory '/root'
2018-01-25 07:34:40,004 [salt.loaded.int.module.cmdmod][INFO    ][27526] Executing command ['apt-cache', '-q', 'policy', 'salt-formula-docker'] in directory '/root'
2018-01-25 07:34:40,049 [salt.loaded.int.module.cmdmod][INFO    ][27526] Executing command ['apt-cache', '-q', 'policy', 'salt-formula-heat'] in directory '/root'
2018-01-25 07:34:40,098 [salt.loaded.int.module.cmdmod][INFO    ][27526] Executing command ['apt-cache', '-q', 'policy', 'salt-formula-reclass'] in directory '/root'
2018-01-25 07:34:40,146 [salt.loaded.int.module.cmdmod][INFO    ][27526] Executing command ['apt-cache', '-q', 'policy', 'salt-formula-redis'] in directory '/root'
2018-01-25 07:34:40,201 [salt.loaded.int.module.cmdmod][INFO    ][27526] Executing command ['apt-cache', '-q', 'policy', 'salt-formula-nova'] in directory '/root'
2018-01-25 07:34:40,249 [salt.loaded.int.module.cmdmod][INFO    ][27526] Executing command ['apt-cache', '-q', 'policy', 'salt-formula-iptables'] in directory '/root'
2018-01-25 07:34:40,298 [salt.loaded.int.module.cmdmod][INFO    ][27526] Executing command ['apt-cache', '-q', 'policy', 'salt-formula-murano'] in directory '/root'
2018-01-25 07:34:40,346 [salt.loaded.int.module.cmdmod][INFO    ][27526] Executing command ['apt-cache', '-q', 'policy', 'salt-formula-glusterfs'] in directory '/root'
2018-01-25 07:34:40,396 [salt.loaded.int.module.cmdmod][INFO    ][27526] Executing command ['apt-cache', '-q', 'policy', 'salt-formula-backupninja'] in directory '/root'
2018-01-25 07:34:40,446 [salt.loaded.int.module.cmdmod][INFO    ][27526] Executing command ['apt-cache', '-q', 'policy', 'salt-formula-kubernetes'] in directory '/root'
2018-01-25 07:34:40,498 [salt.loaded.int.module.cmdmod][INFO    ][27526] Executing command ['apt-cache', '-q', 'policy', 'salt-formula-linux'] in directory '/root'
2018-01-25 07:34:40,554 [salt.loaded.int.module.cmdmod][INFO    ][27526] Executing command ['apt-cache', '-q', 'policy', 'salt-formula-git'] in directory '/root'
2018-01-25 07:34:40,603 [salt.loaded.int.module.cmdmod][INFO    ][27526] Executing command ['apt-cache', '-q', 'policy', 'salt-formula-apache'] in directory '/root'
2018-01-25 07:34:40,651 [salt.loaded.int.module.cmdmod][INFO    ][27526] Executing command ['apt-cache', '-q', 'policy', 'salt-formula-aptly'] in directory '/root'
2018-01-25 07:34:40,701 [salt.loaded.int.module.cmdmod][INFO    ][27526] Executing command ['apt-cache', '-q', 'policy', 'salt-formula-gerrit'] in directory '/root'
2018-01-25 07:34:40,749 [salt.loaded.int.module.cmdmod][INFO    ][27526] Executing command ['apt-cache', '-q', 'policy', 'salt-formula-sensu'] in directory '/root'
2018-01-25 07:34:40,797 [salt.loaded.int.module.cmdmod][INFO    ][27526] Executing command ['apt-cache', '-q', 'policy', 'salt-formula-aptcacher'] in directory '/root'
2018-01-25 07:34:40,844 [salt.loaded.int.module.cmdmod][INFO    ][27526] Executing command ['apt-cache', '-q', 'policy', 'salt-formula-glance'] in directory '/root'
2018-01-25 07:34:40,894 [salt.loaded.int.module.cmdmod][INFO    ][27526] Executing command ['apt-cache', '-q', 'policy', 'salt-formula-heka'] in directory '/root'
2018-01-25 07:34:40,949 [salt.loaded.int.module.cmdmod][INFO    ][27526] Executing command ['apt-cache', '-q', 'policy', 'salt-formula-keystone'] in directory '/root'
2018-01-25 07:34:40,996 [salt.loaded.int.module.cmdmod][INFO    ][27526] Executing command ['apt-cache', '-q', 'policy', 'salt-formula-ntp'] in directory '/root'
2018-01-25 07:34:41,043 [salt.loaded.int.module.cmdmod][INFO    ][27526] Executing command ['apt-cache', '-q', 'policy', 'salt-formula-barbican'] in directory '/root'
2018-01-25 07:34:41,098 [salt.loaded.int.module.cmdmod][INFO    ][27526] Executing command ['apt-cache', '-q', 'policy', 'salt-formula-aodh'] in directory '/root'
2018-01-25 07:34:41,146 [salt.loaded.int.module.cmdmod][INFO    ][27526] Executing command ['apt-cache', '-q', 'policy', 'salt-formula-python'] in directory '/root'
2018-01-25 07:34:41,195 [salt.loaded.int.module.cmdmod][INFO    ][27526] Executing command ['apt-cache', '-q', 'policy', 'salt-formula-collectd'] in directory '/root'
2018-01-25 07:34:41,242 [salt.loaded.int.module.cmdmod][INFO    ][27526] Executing command ['apt-cache', '-q', 'policy', 'salt-formula-neutron'] in directory '/root'
2018-01-25 07:34:41,290 [salt.loaded.int.module.cmdmod][INFO    ][27526] Executing command ['apt-cache', '-q', 'policy', 'salt-formula-supervisor'] in directory '/root'
2018-01-25 07:34:41,337 [salt.loaded.int.module.cmdmod][INFO    ][27526] Executing command ['apt-cache', '-q', 'policy', 'salt-formula-ceilometer'] in directory '/root'
2018-01-25 07:34:41,387 [salt.loaded.int.module.cmdmod][INFO    ][27526] Executing command ['apt-cache', '-q', 'policy', 'salt-formula-elasticsearch'] in directory '/root'
2018-01-25 07:34:41,435 [salt.loaded.int.module.cmdmod][INFO    ][27526] Executing command ['apt-cache', '-q', 'policy', 'salt-formula-powerdns'] in directory '/root'
2018-01-25 07:34:41,483 [salt.loaded.int.module.cmdmod][INFO    ][27526] Executing command ['apt-cache', '-q', 'policy', 'salt-formula-cassandra'] in directory '/root'
2018-01-25 07:34:41,535 [salt.loaded.int.module.cmdmod][INFO    ][27526] Executing command ['apt-cache', '-q', 'policy', 'salt-formula-libvirt'] in directory '/root'
2018-01-25 07:34:41,589 [salt.loaded.int.module.cmdmod][INFO    ][27526] Executing command ['apt-cache', '-q', 'policy', 'salt-formula-sahara'] in directory '/root'
2018-01-25 07:34:41,644 [salt.loaded.int.module.cmdmod][INFO    ][27526] Executing command ['apt-cache', '-q', 'policy', 'salt-formula-openssh'] in directory '/root'
2018-01-25 07:34:41,698 [salt.loaded.int.module.cmdmod][INFO    ][27526] Executing command ['apt-cache', '-q', 'policy', 'salt-formula-statsd'] in directory '/root'
2018-01-25 07:34:41,753 [salt.loaded.int.module.cmdmod][INFO    ][27526] Executing command ['apt-cache', '-q', 'policy', 'salt-formula-mongodb'] in directory '/root'
2018-01-25 07:34:41,819 [salt.loaded.int.module.cmdmod][INFO    ][27526] Executing command ['apt-cache', '-q', 'policy', 'salt-formula-kibana'] in directory '/root'
2018-01-25 07:34:41,868 [salt.loaded.int.module.cmdmod][INFO    ][27526] Executing command ['apt-cache', '-q', 'policy', 'salt-formula-sphinx'] in directory '/root'
2018-01-25 07:34:41,915 [salt.loaded.int.module.cmdmod][INFO    ][27526] Executing command ['apt-cache', '-q', 'policy', 'salt-formula-freeipa'] in directory '/root'
2018-01-25 07:34:41,963 [salt.loaded.int.module.cmdmod][INFO    ][27526] Executing command ['apt-cache', '-q', 'policy', 'salt-formula-octavia'] in directory '/root'
2018-01-25 07:34:42,010 [salt.loaded.int.module.cmdmod][INFO    ][27526] Executing command ['apt-cache', '-q', 'policy', 'salt-formula-bind'] in directory '/root'
2018-01-25 07:34:42,060 [salt.loaded.int.module.cmdmod][INFO    ][27526] Executing command ['apt-cache', '-q', 'policy', 'salt-formula-salt'] in directory '/root'
2018-01-25 07:34:42,110 [salt.loaded.int.module.cmdmod][INFO    ][27526] Executing command ['apt-cache', '-q', 'policy', 'salt-formula-etcd'] in directory '/root'
2018-01-25 07:34:42,162 [salt.loaded.int.module.cmdmod][INFO    ][27526] Executing command ['apt-cache', '-q', 'policy', 'salt-formula-devops-portal'] in directory '/root'
2018-01-25 07:34:42,213 [salt.loaded.int.module.cmdmod][INFO    ][27526] Executing command ['apt-cache', '-q', 'policy', 'salt-formula-postgresql'] in directory '/root'
2018-01-25 07:34:42,267 [salt.loaded.int.module.cmdmod][INFO    ][27526] Executing command ['apt-cache', '-q', 'policy', 'salt-formula-avinetworks'] in directory '/root'
2018-01-25 07:34:42,317 [salt.loaded.int.module.cmdmod][INFO    ][27526] Executing command ['apt-cache', '-q', 'policy', 'salt-formula-nginx'] in directory '/root'
2018-01-25 07:34:42,366 [salt.loaded.int.module.cmdmod][INFO    ][27526] Executing command ['apt-cache', '-q', 'policy', 'salt-formula-mysql'] in directory '/root'
2018-01-25 07:34:42,414 [salt.loaded.int.module.cmdmod][INFO    ][27526] Executing command ['apt-cache', '-q', 'policy', 'salt-formula-ceph'] in directory '/root'
2018-01-25 07:34:42,463 [salt.loaded.int.module.cmdmod][INFO    ][27526] Executing command ['apt-cache', '-q', 'policy', 'salt-formula-horizon'] in directory '/root'
2018-01-25 07:34:42,513 [salt.loaded.int.module.cmdmod][INFO    ][27526] Executing command ['apt-cache', '-q', 'policy', 'salt-formula-haproxy'] in directory '/root'
2018-01-25 07:34:42,562 [salt.loaded.int.module.cmdmod][INFO    ][27526] Executing command ['apt-cache', '-q', 'policy', 'salt-formula-java'] in directory '/root'
2018-01-25 07:34:42,607 [salt.loaded.int.module.cmdmod][INFO    ][27526] Executing command ['apt-cache', '-q', 'policy', 'salt-formula-billometer'] in directory '/root'
2018-01-25 07:34:42,653 [salt.loaded.int.module.cmdmod][INFO    ][27526] Executing command ['apt-cache', '-q', 'policy', 'salt-formula-telegraf'] in directory '/root'
2018-01-25 07:34:42,701 [salt.loaded.int.module.cmdmod][INFO    ][27526] Executing command ['apt-cache', '-q', 'policy', 'salt-formula-designate'] in directory '/root'
2018-01-25 07:34:42,746 [salt.loaded.int.module.cmdmod][INFO    ][27526] Executing command ['apt-cache', '-q', 'policy', 'salt-formula-keepalived'] in directory '/root'
2018-01-25 07:34:42,793 [salt.loaded.int.module.cmdmod][INFO    ][27526] Executing command ['apt-cache', '-q', 'policy', 'salt-formula-rundeck'] in directory '/root'
2018-01-25 07:34:42,843 [salt.loaded.int.module.cmdmod][INFO    ][27526] Executing command ['apt-cache', '-q', 'policy', 'salt-formula-ccp'] in directory '/root'
2018-01-25 07:34:42,891 [salt.loaded.int.module.cmdmod][INFO    ][27526] Executing command ['apt-cache', '-q', 'policy', 'salt-formula-tinyproxy'] in directory '/root'
2018-01-25 07:34:42,939 [salt.loaded.int.module.cmdmod][INFO    ][27526] Executing command ['apt-cache', '-q', 'policy', 'salt-formula-rabbitmq'] in directory '/root'
2018-01-25 07:34:42,987 [salt.loaded.int.module.cmdmod][INFO    ][27526] Executing command ['apt-cache', '-q', 'policy', 'salt-formula-openldap'] in directory '/root'
2018-01-25 07:34:43,039 [salt.loaded.int.module.cmdmod][INFO    ][27526] Executing command ['apt-cache', '-q', 'policy', 'salt-formula-influxdb'] in directory '/root'
2018-01-25 07:34:43,089 [salt.loaded.int.module.cmdmod][INFO    ][27526] Executing command ['apt-cache', '-q', 'policy', 'salt-formula-memcached'] in directory '/root'
2018-01-25 07:34:43,137 [salt.loaded.int.module.cmdmod][INFO    ][27526] Executing command ['apt-cache', '-q', 'policy', 'salt-formula-prometheus'] in directory '/root'
2018-01-25 07:34:43,187 [salt.loaded.int.module.cmdmod][INFO    ][27526] Executing command ['apt-cache', '-q', 'policy', 'salt-formula-helm'] in directory '/root'
2018-01-25 07:34:43,236 [salt.loaded.int.module.cmdmod][INFO    ][27526] Executing command ['apt-cache', '-q', 'policy', 'salt-formula-opencontrail'] in directory '/root'
2018-01-25 07:34:43,286 [salt.loaded.int.module.cmdmod][INFO    ][27526] Executing command ['apt-cache', '-q', 'policy', 'salt-formula-jenkins'] in directory '/root'
2018-01-25 07:34:43,336 [salt.loaded.int.module.cmdmod][INFO    ][27526] Executing command ['apt-cache', '-q', 'policy', 'salt-formula-lldp'] in directory '/root'
2018-01-25 07:34:43,383 [salt.loaded.int.module.cmdmod][INFO    ][27526] Executing command ['apt-cache', '-q', 'policy', 'salt-formula-nagios'] in directory '/root'
2018-01-25 07:34:43,438 [salt.loaded.int.module.cmdmod][INFO    ][27526] Executing command ['apt-cache', '-q', 'policy', 'salt-formula-swift'] in directory '/root'
2018-01-25 07:34:43,489 [salt.loaded.int.module.cmdmod][INFO    ][27526] Executing command ['apt-cache', '-q', 'policy', 'salt-formula-zookeeper'] in directory '/root'
2018-01-25 07:34:43,540 [salt.loaded.int.module.cmdmod][INFO    ][27526] Executing command ['apt-cache', '-q', 'policy', 'salt-formula-galera'] in directory '/root'
2018-01-25 07:34:43,591 [salt.loaded.int.module.cmdmod][INFO    ][27526] Executing command ['apt-cache', '-q', 'policy', 'salt-formula-graphite'] in directory '/root'
2018-01-25 07:34:43,643 [salt.loaded.int.module.cmdmod][INFO    ][27526] Executing command ['apt-cache', '-q', 'policy', 'salt-formula-cinder'] in directory '/root'
2018-01-25 07:34:43,696 [salt.loaded.int.module.cmdmod][INFO    ][27526] Executing command ['apt-cache', '-q', 'policy', 'salt-formula-rsyslog'] in directory '/root'
2018-01-25 07:34:43,750 [salt.state       ][INFO    ][27526] All 78 packages are up-to-date.
2018-01-25 07:34:43,750 [salt.state       ][INFO    ][27526] Completed state [salt_master_prd_pkg_formulas] at time 07:34:43.750874 duration_in_ms=3899.363
2018-01-25 07:34:43,751 [salt.state       ][INFO    ][27526] Running state [/srv/salt/reclass] at time 07:34:43.751493
2018-01-25 07:34:43,752 [salt.state       ][INFO    ][27526] Executing state file.directory for /srv/salt/reclass
2018-01-25 07:34:43,753 [salt.state       ][INFO    ][27526] Directory /srv/salt/reclass is in the correct state
2018-01-25 07:34:43,754 [salt.state       ][INFO    ][27526] Completed state [/srv/salt/reclass] at time 07:34:43.753997 duration_in_ms=2.504
2018-01-25 07:34:43,755 [salt.state       ][INFO    ][27526] Running state [/srv/salt/reclass/classes/service] at time 07:34:43.755923
2018-01-25 07:34:43,756 [salt.state       ][INFO    ][27526] Executing state file.directory for /srv/salt/reclass/classes/service
2018-01-25 07:34:43,757 [salt.state       ][INFO    ][27526] Directory /srv/salt/reclass/classes/service is in the correct state
2018-01-25 07:34:43,757 [salt.state       ][INFO    ][27526] Completed state [/srv/salt/reclass/classes/service] at time 07:34:43.757840 duration_in_ms=1.917
2018-01-25 07:34:43,759 [salt.state       ][INFO    ][27526] Running state [/srv/salt/reclass/classes/service/powerdns] at time 07:34:43.759331
2018-01-25 07:34:43,759 [salt.state       ][INFO    ][27526] Executing state file.symlink for /srv/salt/reclass/classes/service/powerdns
2018-01-25 07:34:43,762 [salt.state       ][INFO    ][27526] Symlink /srv/salt/reclass/classes/service/powerdns is present and owned by root:root
2018-01-25 07:34:43,762 [salt.state       ][INFO    ][27526] Completed state [/srv/salt/reclass/classes/service/powerdns] at time 07:34:43.762578 duration_in_ms=3.247
2018-01-25 07:34:43,763 [salt.state       ][INFO    ][27526] Running state [/srv/salt/reclass/classes/service/galera] at time 07:34:43.763850
2018-01-25 07:34:43,764 [salt.state       ][INFO    ][27526] Executing state file.symlink for /srv/salt/reclass/classes/service/galera
2018-01-25 07:34:43,766 [salt.state       ][INFO    ][27526] Symlink /srv/salt/reclass/classes/service/galera is present and owned by root:root
2018-01-25 07:34:43,766 [salt.state       ][INFO    ][27526] Completed state [/srv/salt/reclass/classes/service/galera] at time 07:34:43.766793 duration_in_ms=2.943
2018-01-25 07:34:43,768 [salt.state       ][INFO    ][27526] Running state [/srv/salt/reclass/classes/service/telegraf] at time 07:34:43.768078
2018-01-25 07:34:43,768 [salt.state       ][INFO    ][27526] Executing state file.symlink for /srv/salt/reclass/classes/service/telegraf
2018-01-25 07:34:43,770 [salt.state       ][INFO    ][27526] Symlink /srv/salt/reclass/classes/service/telegraf is present and owned by root:root
2018-01-25 07:34:43,771 [salt.state       ][INFO    ][27526] Completed state [/srv/salt/reclass/classes/service/telegraf] at time 07:34:43.771000 duration_in_ms=2.922
2018-01-25 07:34:43,772 [salt.state       ][INFO    ][27526] Running state [/srv/salt/reclass/classes/service/supervisor] at time 07:34:43.772256
2018-01-25 07:34:43,772 [salt.state       ][INFO    ][27526] Executing state file.symlink for /srv/salt/reclass/classes/service/supervisor
2018-01-25 07:34:43,774 [salt.state       ][INFO    ][27526] Symlink /srv/salt/reclass/classes/service/supervisor is present and owned by root:root
2018-01-25 07:34:43,775 [salt.state       ][INFO    ][27526] Completed state [/srv/salt/reclass/classes/service/supervisor] at time 07:34:43.775221 duration_in_ms=2.965
2018-01-25 07:34:43,776 [salt.state       ][INFO    ][27526] Running state [/srv/salt/reclass/classes/service/sensu] at time 07:34:43.776516
2018-01-25 07:34:43,777 [salt.state       ][INFO    ][27526] Executing state file.symlink for /srv/salt/reclass/classes/service/sensu
2018-01-25 07:34:43,779 [salt.state       ][INFO    ][27526] Symlink /srv/salt/reclass/classes/service/sensu is present and owned by root:root
2018-01-25 07:34:43,779 [salt.state       ][INFO    ][27526] Completed state [/srv/salt/reclass/classes/service/sensu] at time 07:34:43.779501 duration_in_ms=2.984
2018-01-25 07:34:43,780 [salt.state       ][INFO    ][27526] Running state [/srv/salt/reclass/classes/service/aodh] at time 07:34:43.780737
2018-01-25 07:34:43,781 [salt.state       ][INFO    ][27526] Executing state file.symlink for /srv/salt/reclass/classes/service/aodh
2018-01-25 07:34:43,783 [salt.state       ][INFO    ][27526] Symlink /srv/salt/reclass/classes/service/aodh is present and owned by root:root
2018-01-25 07:34:43,783 [salt.state       ][INFO    ][27526] Completed state [/srv/salt/reclass/classes/service/aodh] at time 07:34:43.783718 duration_in_ms=2.982
2018-01-25 07:34:43,785 [salt.state       ][INFO    ][27526] Running state [/srv/salt/reclass/classes/service/tinyproxy] at time 07:34:43.784961
2018-01-25 07:34:43,785 [salt.state       ][INFO    ][27526] Executing state file.symlink for /srv/salt/reclass/classes/service/tinyproxy
2018-01-25 07:34:43,787 [salt.state       ][INFO    ][27526] Symlink /srv/salt/reclass/classes/service/tinyproxy is present and owned by root:root
2018-01-25 07:34:43,788 [salt.state       ][INFO    ][27526] Completed state [/srv/salt/reclass/classes/service/tinyproxy] at time 07:34:43.788234 duration_in_ms=3.273
2018-01-25 07:34:43,789 [salt.state       ][INFO    ][27526] Running state [/srv/salt/reclass/classes/service/collectd] at time 07:34:43.789496
2018-01-25 07:34:43,790 [salt.state       ][INFO    ][27526] Executing state file.symlink for /srv/salt/reclass/classes/service/collectd
2018-01-25 07:34:43,792 [salt.state       ][INFO    ][27526] Symlink /srv/salt/reclass/classes/service/collectd is present and owned by root:root
2018-01-25 07:34:43,792 [salt.state       ][INFO    ][27526] Completed state [/srv/salt/reclass/classes/service/collectd] at time 07:34:43.792471 duration_in_ms=2.975
2018-01-25 07:34:43,793 [salt.state       ][INFO    ][27526] Running state [/srv/salt/reclass/classes/service/nagios] at time 07:34:43.793713
2018-01-25 07:34:43,794 [salt.state       ][INFO    ][27526] Executing state file.symlink for /srv/salt/reclass/classes/service/nagios
2018-01-25 07:34:43,796 [salt.state       ][INFO    ][27526] Symlink /srv/salt/reclass/classes/service/nagios is present and owned by root:root
2018-01-25 07:34:43,796 [salt.state       ][INFO    ][27526] Completed state [/srv/salt/reclass/classes/service/nagios] at time 07:34:43.796686 duration_in_ms=2.972
2018-01-25 07:34:43,797 [salt.state       ][INFO    ][27526] Running state [/srv/salt/reclass/classes/service/ceph] at time 07:34:43.797931
2018-01-25 07:34:43,798 [salt.state       ][INFO    ][27526] Executing state file.symlink for /srv/salt/reclass/classes/service/ceph
2018-01-25 07:34:43,800 [salt.state       ][INFO    ][27526] Symlink /srv/salt/reclass/classes/service/ceph is present and owned by root:root
2018-01-25 07:34:43,801 [salt.state       ][INFO    ][27526] Completed state [/srv/salt/reclass/classes/service/ceph] at time 07:34:43.801236 duration_in_ms=3.305
2018-01-25 07:34:43,802 [salt.state       ][INFO    ][27526] Running state [/srv/salt/reclass/classes/service/apache] at time 07:34:43.802553
2018-01-25 07:34:43,803 [salt.state       ][INFO    ][27526] Executing state file.symlink for /srv/salt/reclass/classes/service/apache
2018-01-25 07:34:43,805 [salt.state       ][INFO    ][27526] Symlink /srv/salt/reclass/classes/service/apache is present and owned by root:root
2018-01-25 07:34:43,805 [salt.state       ][INFO    ][27526] Completed state [/srv/salt/reclass/classes/service/apache] at time 07:34:43.805630 duration_in_ms=3.077
2018-01-25 07:34:43,806 [salt.state       ][INFO    ][27526] Running state [/srv/salt/reclass/classes/service/glusterfs] at time 07:34:43.806851
2018-01-25 07:34:43,807 [salt.state       ][INFO    ][27526] Executing state file.symlink for /srv/salt/reclass/classes/service/glusterfs
2018-01-25 07:34:43,809 [salt.state       ][INFO    ][27526] Symlink /srv/salt/reclass/classes/service/glusterfs is present and owned by root:root
2018-01-25 07:34:43,809 [salt.state       ][INFO    ][27526] Completed state [/srv/salt/reclass/classes/service/glusterfs] at time 07:34:43.809871 duration_in_ms=3.02
2018-01-25 07:34:43,811 [salt.state       ][INFO    ][27526] Running state [/srv/salt/reclass/classes/service/xtrabackup] at time 07:34:43.811106
2018-01-25 07:34:43,811 [salt.state       ][INFO    ][27526] Executing state file.symlink for /srv/salt/reclass/classes/service/xtrabackup
2018-01-25 07:34:43,813 [salt.state       ][INFO    ][27526] Symlink /srv/salt/reclass/classes/service/xtrabackup is present and owned by root:root
2018-01-25 07:34:43,814 [salt.state       ][INFO    ][27526] Completed state [/srv/salt/reclass/classes/service/xtrabackup] at time 07:34:43.814190 duration_in_ms=3.084
2018-01-25 07:34:43,815 [salt.state       ][INFO    ][27526] Running state [/srv/salt/reclass/classes/service/sahara] at time 07:34:43.815498
2018-01-25 07:34:43,816 [salt.state       ][INFO    ][27526] Executing state file.symlink for /srv/salt/reclass/classes/service/sahara
2018-01-25 07:34:43,818 [salt.state       ][INFO    ][27526] Symlink /srv/salt/reclass/classes/service/sahara is present and owned by root:root
2018-01-25 07:34:43,818 [salt.state       ][INFO    ][27526] Completed state [/srv/salt/reclass/classes/service/sahara] at time 07:34:43.818493 duration_in_ms=2.995
2018-01-25 07:34:43,819 [salt.state       ][INFO    ][27526] Running state [/srv/salt/reclass/classes/service/backupninja] at time 07:34:43.819798
2018-01-25 07:34:43,823 [salt.state       ][INFO    ][27526] Executing state file.symlink for /srv/salt/reclass/classes/service/backupninja
2018-01-25 07:34:43,826 [salt.state       ][INFO    ][27526] Symlink /srv/salt/reclass/classes/service/backupninja is present and owned by root:root
2018-01-25 07:34:43,826 [salt.state       ][INFO    ][27526] Completed state [/srv/salt/reclass/classes/service/backupninja] at time 07:34:43.826895 duration_in_ms=7.096
2018-01-25 07:34:43,828 [salt.state       ][INFO    ][27526] Running state [/srv/salt/reclass/classes/service/rsyslog] at time 07:34:43.828346
2018-01-25 07:34:43,828 [salt.state       ][INFO    ][27526] Executing state file.symlink for /srv/salt/reclass/classes/service/rsyslog
2018-01-25 07:34:43,831 [salt.state       ][INFO    ][27526] Symlink /srv/salt/reclass/classes/service/rsyslog is present and owned by root:root
2018-01-25 07:34:43,831 [salt.state       ][INFO    ][27526] Completed state [/srv/salt/reclass/classes/service/rsyslog] at time 07:34:43.831609 duration_in_ms=3.263
2018-01-25 07:34:43,832 [salt.state       ][INFO    ][27526] Running state [/srv/salt/reclass/classes/service/mysql] at time 07:34:43.832837
2018-01-25 07:34:43,833 [salt.state       ][INFO    ][27526] Executing state file.symlink for /srv/salt/reclass/classes/service/mysql
2018-01-25 07:34:43,835 [salt.state       ][INFO    ][27526] Symlink /srv/salt/reclass/classes/service/mysql is present and owned by root:root
2018-01-25 07:34:43,835 [salt.state       ][INFO    ][27526] Completed state [/srv/salt/reclass/classes/service/mysql] at time 07:34:43.835859 duration_in_ms=3.022
2018-01-25 07:34:43,837 [salt.state       ][INFO    ][27526] Running state [/srv/salt/reclass/classes/service/helm] at time 07:34:43.837079
2018-01-25 07:34:43,837 [salt.state       ][INFO    ][27526] Executing state file.symlink for /srv/salt/reclass/classes/service/helm
2018-01-25 07:34:43,839 [salt.state       ][INFO    ][27526] Symlink /srv/salt/reclass/classes/service/helm is present and owned by root:root
2018-01-25 07:34:43,840 [salt.state       ][INFO    ][27526] Completed state [/srv/salt/reclass/classes/service/helm] at time 07:34:43.840346 duration_in_ms=3.267
2018-01-25 07:34:43,841 [salt.state       ][INFO    ][27526] Running state [/srv/salt/reclass/classes/service/freeipa] at time 07:34:43.841581
2018-01-25 07:34:43,842 [salt.state       ][INFO    ][27526] Executing state file.symlink for /srv/salt/reclass/classes/service/freeipa
2018-01-25 07:34:43,844 [salt.state       ][INFO    ][27526] Symlink /srv/salt/reclass/classes/service/freeipa is present and owned by root:root
2018-01-25 07:34:43,844 [salt.state       ][INFO    ][27526] Completed state [/srv/salt/reclass/classes/service/freeipa] at time 07:34:43.844598 duration_in_ms=3.017
2018-01-25 07:34:43,845 [salt.state       ][INFO    ][27526] Running state [/srv/salt/reclass/classes/service/barbican] at time 07:34:43.845833
2018-01-25 07:34:43,846 [salt.state       ][INFO    ][27526] Executing state file.symlink for /srv/salt/reclass/classes/service/barbican
2018-01-25 07:34:43,848 [salt.state       ][INFO    ][27526] Symlink /srv/salt/reclass/classes/service/barbican is present and owned by root:root
2018-01-25 07:34:43,848 [salt.state       ][INFO    ][27526] Completed state [/srv/salt/reclass/classes/service/barbican] at time 07:34:43.848843 duration_in_ms=3.009
2018-01-25 07:34:43,850 [salt.state       ][INFO    ][27526] Running state [/srv/salt/reclass/classes/service/grafana] at time 07:34:43.850125
2018-01-25 07:34:43,850 [salt.state       ][INFO    ][27526] Executing state file.symlink for /srv/salt/reclass/classes/service/grafana
2018-01-25 07:34:43,852 [salt.state       ][INFO    ][27526] Symlink /srv/salt/reclass/classes/service/grafana is present and owned by root:root
2018-01-25 07:34:43,853 [salt.state       ][INFO    ][27526] Completed state [/srv/salt/reclass/classes/service/grafana] at time 07:34:43.853122 duration_in_ms=2.997
2018-01-25 07:34:43,854 [salt.state       ][INFO    ][27526] Running state [/srv/salt/reclass/classes/service/aptly] at time 07:34:43.854350
2018-01-25 07:34:43,854 [salt.state       ][INFO    ][27526] Executing state file.symlink for /srv/salt/reclass/classes/service/aptly
2018-01-25 07:34:43,856 [salt.state       ][INFO    ][27526] Symlink /srv/salt/reclass/classes/service/aptly is present and owned by root:root
2018-01-25 07:34:43,857 [salt.state       ][INFO    ][27526] Completed state [/srv/salt/reclass/classes/service/aptly] at time 07:34:43.857298 duration_in_ms=2.948
2018-01-25 07:34:43,858 [salt.state       ][INFO    ][27526] Running state [/srv/salt/reclass/classes/service/cassandra] at time 07:34:43.858542
2018-01-25 07:34:43,859 [salt.state       ][INFO    ][27526] Executing state file.symlink for /srv/salt/reclass/classes/service/cassandra
2018-01-25 07:34:43,861 [salt.state       ][INFO    ][27526] Symlink /srv/salt/reclass/classes/service/cassandra is present and owned by root:root
2018-01-25 07:34:43,862 [salt.state       ][INFO    ][27526] Completed state [/srv/salt/reclass/classes/service/cassandra] at time 07:34:43.862266 duration_in_ms=3.723
2018-01-25 07:34:43,863 [salt.state       ][INFO    ][27526] Running state [/srv/salt/reclass/classes/service/lldp] at time 07:34:43.863590
2018-01-25 07:34:43,863 [salt.state       ][INFO    ][27526] Executing state file.symlink for /srv/salt/reclass/classes/service/lldp
2018-01-25 07:34:43,866 [salt.state       ][INFO    ][27526] Symlink /srv/salt/reclass/classes/service/lldp is present and owned by root:root
2018-01-25 07:34:43,866 [salt.state       ][INFO    ][27526] Completed state [/srv/salt/reclass/classes/service/lldp] at time 07:34:43.866203 duration_in_ms=2.613
2018-01-25 07:34:43,867 [salt.state       ][INFO    ][27526] Running state [/srv/salt/reclass/classes/service/git] at time 07:34:43.867250
2018-01-25 07:34:43,867 [salt.state       ][INFO    ][27526] Executing state file.symlink for /srv/salt/reclass/classes/service/git
2018-01-25 07:34:43,869 [salt.state       ][INFO    ][27526] Symlink /srv/salt/reclass/classes/service/git is present and owned by root:root
2018-01-25 07:34:43,869 [salt.state       ][INFO    ][27526] Completed state [/srv/salt/reclass/classes/service/git] at time 07:34:43.869553 duration_in_ms=2.303
2018-01-25 07:34:43,870 [salt.state       ][INFO    ][27526] Running state [/srv/salt/reclass/classes/service/java] at time 07:34:43.870600
2018-01-25 07:34:43,870 [salt.state       ][INFO    ][27526] Executing state file.symlink for /srv/salt/reclass/classes/service/java
2018-01-25 07:34:43,872 [salt.state       ][INFO    ][27526] Symlink /srv/salt/reclass/classes/service/java is present and owned by root:root
2018-01-25 07:34:43,873 [salt.state       ][INFO    ][27526] Completed state [/srv/salt/reclass/classes/service/java] at time 07:34:43.873010 duration_in_ms=2.41
2018-01-25 07:34:43,874 [salt.state       ][INFO    ][27526] Running state [/srv/salt/reclass/classes/service/reclass] at time 07:34:43.874633
2018-01-25 07:34:43,874 [salt.state       ][INFO    ][27526] Executing state file.symlink for /srv/salt/reclass/classes/service/reclass
2018-01-25 07:34:43,876 [salt.state       ][INFO    ][27526] Symlink /srv/salt/reclass/classes/service/reclass is present and owned by root:root
2018-01-25 07:34:43,877 [salt.state       ][INFO    ][27526] Completed state [/srv/salt/reclass/classes/service/reclass] at time 07:34:43.877031 duration_in_ms=2.398
2018-01-25 07:34:43,878 [salt.state       ][INFO    ][27526] Running state [/srv/salt/reclass/classes/service/linux] at time 07:34:43.878160
2018-01-25 07:34:43,878 [salt.state       ][INFO    ][27526] Executing state file.symlink for /srv/salt/reclass/classes/service/linux
2018-01-25 07:34:43,880 [salt.state       ][INFO    ][27526] Symlink /srv/salt/reclass/classes/service/linux is present and owned by root:root
2018-01-25 07:34:43,880 [salt.state       ][INFO    ][27526] Completed state [/srv/salt/reclass/classes/service/linux] at time 07:34:43.880509 duration_in_ms=2.349
2018-01-25 07:34:43,881 [salt.state       ][INFO    ][27526] Running state [/srv/salt/reclass/classes/service/glance] at time 07:34:43.881577
2018-01-25 07:34:43,881 [salt.state       ][INFO    ][27526] Executing state file.symlink for /srv/salt/reclass/classes/service/glance
2018-01-25 07:34:43,883 [salt.state       ][INFO    ][27526] Symlink /srv/salt/reclass/classes/service/glance is present and owned by root:root
2018-01-25 07:34:43,884 [salt.state       ][INFO    ][27526] Completed state [/srv/salt/reclass/classes/service/glance] at time 07:34:43.883909 duration_in_ms=2.332
2018-01-25 07:34:43,885 [salt.state       ][INFO    ][27526] Running state [/srv/salt/reclass/classes/service/keepalived] at time 07:34:43.884983
2018-01-25 07:34:43,885 [salt.state       ][INFO    ][27526] Executing state file.symlink for /srv/salt/reclass/classes/service/keepalived
2018-01-25 07:34:43,887 [salt.state       ][INFO    ][27526] Symlink /srv/salt/reclass/classes/service/keepalived is present and owned by root:root
2018-01-25 07:34:43,887 [salt.state       ][INFO    ][27526] Completed state [/srv/salt/reclass/classes/service/keepalived] at time 07:34:43.887669 duration_in_ms=2.686
2018-01-25 07:34:43,888 [salt.state       ][INFO    ][27526] Running state [/srv/salt/reclass/classes/service/nova] at time 07:34:43.888721
2018-01-25 07:34:43,889 [salt.state       ][INFO    ][27526] Executing state file.symlink for /srv/salt/reclass/classes/service/nova
2018-01-25 07:34:43,890 [salt.state       ][INFO    ][27526] Symlink /srv/salt/reclass/classes/service/nova is present and owned by root:root
2018-01-25 07:34:43,891 [salt.state       ][INFO    ][27526] Completed state [/srv/salt/reclass/classes/service/nova] at time 07:34:43.891033 duration_in_ms=2.312
2018-01-25 07:34:43,892 [salt.state       ][INFO    ][27526] Running state [/srv/salt/reclass/classes/service/rundeck] at time 07:34:43.892158
2018-01-25 07:34:43,892 [salt.state       ][INFO    ][27526] Executing state file.symlink for /srv/salt/reclass/classes/service/rundeck
2018-01-25 07:34:43,894 [salt.state       ][INFO    ][27526] Symlink /srv/salt/reclass/classes/service/rundeck is present and owned by root:root
2018-01-25 07:34:43,894 [salt.state       ][INFO    ][27526] Completed state [/srv/salt/reclass/classes/service/rundeck] at time 07:34:43.894463 duration_in_ms=2.305
2018-01-25 07:34:43,895 [salt.state       ][INFO    ][27526] Running state [/srv/salt/reclass/classes/service/murano] at time 07:34:43.895586
2018-01-25 07:34:43,895 [salt.state       ][INFO    ][27526] Executing state file.symlink for /srv/salt/reclass/classes/service/murano
2018-01-25 07:34:43,897 [salt.state       ][INFO    ][27526] Symlink /srv/salt/reclass/classes/service/murano is present and owned by root:root
2018-01-25 07:34:43,898 [salt.state       ][INFO    ][27526] Completed state [/srv/salt/reclass/classes/service/murano] at time 07:34:43.897922 duration_in_ms=2.336
2018-01-25 07:34:43,899 [salt.state       ][INFO    ][27526] Running state [/srv/salt/reclass/classes/service/keystone] at time 07:34:43.899003
2018-01-25 07:34:43,899 [salt.state       ][INFO    ][27526] Executing state file.symlink for /srv/salt/reclass/classes/service/keystone
2018-01-25 07:34:43,901 [salt.state       ][INFO    ][27526] Symlink /srv/salt/reclass/classes/service/keystone is present and owned by root:root
2018-01-25 07:34:43,901 [salt.state       ][INFO    ][27526] Completed state [/srv/salt/reclass/classes/service/keystone] at time 07:34:43.901635 duration_in_ms=2.632
2018-01-25 07:34:43,902 [salt.state       ][INFO    ][27526] Running state [/srv/salt/reclass/classes/service/etcd] at time 07:34:43.902728
2018-01-25 07:34:43,903 [salt.state       ][INFO    ][27526] Executing state file.symlink for /srv/salt/reclass/classes/service/etcd
2018-01-25 07:34:43,904 [salt.state       ][INFO    ][27526] Symlink /srv/salt/reclass/classes/service/etcd is present and owned by root:root
2018-01-25 07:34:43,905 [salt.state       ][INFO    ][27526] Completed state [/srv/salt/reclass/classes/service/etcd] at time 07:34:43.905069 duration_in_ms=2.341
2018-01-25 07:34:43,906 [salt.state       ][INFO    ][27526] Running state [/srv/salt/reclass/classes/service/ntp] at time 07:34:43.906169
2018-01-25 07:34:43,906 [salt.state       ][INFO    ][27526] Executing state file.symlink for /srv/salt/reclass/classes/service/ntp
2018-01-25 07:34:43,908 [salt.state       ][INFO    ][27526] Symlink /srv/salt/reclass/classes/service/ntp is present and owned by root:root
2018-01-25 07:34:43,908 [salt.state       ][INFO    ][27526] Completed state [/srv/salt/reclass/classes/service/ntp] at time 07:34:43.908503 duration_in_ms=2.334
2018-01-25 07:34:43,909 [salt.state       ][INFO    ][27526] Running state [/srv/salt/reclass/classes/service/jenkins] at time 07:34:43.909615
2018-01-25 07:34:43,909 [salt.state       ][INFO    ][27526] Executing state file.symlink for /srv/salt/reclass/classes/service/jenkins
2018-01-25 07:34:43,911 [salt.state       ][INFO    ][27526] Symlink /srv/salt/reclass/classes/service/jenkins is present and owned by root:root
2018-01-25 07:34:43,912 [salt.state       ][INFO    ][27526] Completed state [/srv/salt/reclass/classes/service/jenkins] at time 07:34:43.912057 duration_in_ms=2.442
2018-01-25 07:34:43,913 [salt.state       ][INFO    ][27526] Running state [/srv/salt/reclass/classes/service/memcached] at time 07:34:43.913141
2018-01-25 07:34:43,913 [salt.state       ][INFO    ][27526] Executing state file.symlink for /srv/salt/reclass/classes/service/memcached
2018-01-25 07:34:43,915 [salt.state       ][INFO    ][27526] Symlink /srv/salt/reclass/classes/service/memcached is present and owned by root:root
2018-01-25 07:34:43,915 [salt.state       ][INFO    ][27526] Completed state [/srv/salt/reclass/classes/service/memcached] at time 07:34:43.915803 duration_in_ms=2.662
2018-01-25 07:34:43,916 [salt.state       ][INFO    ][27526] Running state [/srv/salt/reclass/classes/service/neutron] at time 07:34:43.916852
2018-01-25 07:34:43,917 [salt.state       ][INFO    ][27526] Executing state file.symlink for /srv/salt/reclass/classes/service/neutron
2018-01-25 07:34:43,918 [salt.state       ][INFO    ][27526] Symlink /srv/salt/reclass/classes/service/neutron is present and owned by root:root
2018-01-25 07:34:43,919 [salt.state       ][INFO    ][27526] Completed state [/srv/salt/reclass/classes/service/neutron] at time 07:34:43.919163 duration_in_ms=2.311
2018-01-25 07:34:43,920 [salt.state       ][INFO    ][27526] Running state [/srv/salt/reclass/classes/service/designate] at time 07:34:43.920269
2018-01-25 07:34:43,920 [salt.state       ][INFO    ][27526] Executing state file.symlink for /srv/salt/reclass/classes/service/designate
2018-01-25 07:34:43,922 [salt.state       ][INFO    ][27526] Symlink /srv/salt/reclass/classes/service/designate is present and owned by root:root
2018-01-25 07:34:43,922 [salt.state       ][INFO    ][27526] Completed state [/srv/salt/reclass/classes/service/designate] at time 07:34:43.922612 duration_in_ms=2.343
2018-01-25 07:34:43,924 [salt.state       ][INFO    ][27526] Running state [/srv/salt/reclass/classes/service/iptables] at time 07:34:43.924005
2018-01-25 07:34:43,924 [salt.state       ][INFO    ][27526] Executing state file.symlink for /srv/salt/reclass/classes/service/iptables
2018-01-25 07:34:43,926 [salt.state       ][INFO    ][27526] Symlink /srv/salt/reclass/classes/service/iptables is present and owned by root:root
2018-01-25 07:34:43,926 [salt.state       ][INFO    ][27526] Completed state [/srv/salt/reclass/classes/service/iptables] at time 07:34:43.926335 duration_in_ms=2.33
2018-01-25 07:34:43,927 [salt.state       ][INFO    ][27526] Running state [/srv/salt/reclass/classes/service/statsd] at time 07:34:43.927431
2018-01-25 07:34:43,927 [salt.state       ][INFO    ][27526] Executing state file.symlink for /srv/salt/reclass/classes/service/statsd
2018-01-25 07:34:43,929 [salt.state       ][INFO    ][27526] Symlink /srv/salt/reclass/classes/service/statsd is present and owned by root:root
2018-01-25 07:34:43,930 [salt.state       ][INFO    ][27526] Completed state [/srv/salt/reclass/classes/service/statsd] at time 07:34:43.930058 duration_in_ms=2.627
2018-01-25 07:34:43,931 [salt.state       ][INFO    ][27526] Running state [/srv/salt/reclass/classes/service/gerrit] at time 07:34:43.931140
2018-01-25 07:34:43,931 [salt.state       ][INFO    ][27526] Executing state file.symlink for /srv/salt/reclass/classes/service/gerrit
2018-01-25 07:34:43,933 [salt.state       ][INFO    ][27526] Symlink /srv/salt/reclass/classes/service/gerrit is present and owned by root:root
2018-01-25 07:34:43,933 [salt.state       ][INFO    ][27526] Completed state [/srv/salt/reclass/classes/service/gerrit] at time 07:34:43.933554 duration_in_ms=2.414
2018-01-25 07:34:43,934 [salt.state       ][INFO    ][27526] Running state [/srv/salt/reclass/classes/service/zookeeper] at time 07:34:43.934555
2018-01-25 07:34:43,934 [salt.state       ][INFO    ][27526] Executing state file.symlink for /srv/salt/reclass/classes/service/zookeeper
2018-01-25 07:34:43,936 [salt.state       ][INFO    ][27526] Symlink /srv/salt/reclass/classes/service/zookeeper is present and owned by root:root
2018-01-25 07:34:43,936 [salt.state       ][INFO    ][27526] Completed state [/srv/salt/reclass/classes/service/zookeeper] at time 07:34:43.936765 duration_in_ms=2.21
2018-01-25 07:34:43,937 [salt.state       ][INFO    ][27526] Running state [/srv/salt/reclass/classes/service/kubernetes] at time 07:34:43.937762
2018-01-25 07:34:43,938 [salt.state       ][INFO    ][27526] Executing state file.symlink for /srv/salt/reclass/classes/service/kubernetes
2018-01-25 07:34:43,939 [salt.state       ][INFO    ][27526] Symlink /srv/salt/reclass/classes/service/kubernetes is present and owned by root:root
2018-01-25 07:34:43,940 [salt.state       ][INFO    ][27526] Completed state [/srv/salt/reclass/classes/service/kubernetes] at time 07:34:43.939975 duration_in_ms=2.213
2018-01-25 07:34:43,941 [salt.state       ][INFO    ][27526] Running state [/srv/salt/reclass/classes/service/python] at time 07:34:43.940961
2018-01-25 07:34:43,941 [salt.state       ][INFO    ][27526] Executing state file.symlink for /srv/salt/reclass/classes/service/python
2018-01-25 07:34:43,943 [salt.state       ][INFO    ][27526] Symlink /srv/salt/reclass/classes/service/python is present and owned by root:root
2018-01-25 07:34:43,943 [salt.state       ][INFO    ][27526] Completed state [/srv/salt/reclass/classes/service/python] at time 07:34:43.943424 duration_in_ms=2.463
2018-01-25 07:34:43,944 [salt.state       ][INFO    ][27526] Running state [/srv/salt/reclass/classes/service/mongodb] at time 07:34:43.944440
2018-01-25 07:34:43,944 [salt.state       ][INFO    ][27526] Executing state file.symlink for /srv/salt/reclass/classes/service/mongodb
2018-01-25 07:34:43,946 [salt.state       ][INFO    ][27526] Symlink /srv/salt/reclass/classes/service/mongodb is present and owned by root:root
2018-01-25 07:34:43,946 [salt.state       ][INFO    ][27526] Completed state [/srv/salt/reclass/classes/service/mongodb] at time 07:34:43.946665 duration_in_ms=2.225
2018-01-25 07:34:43,947 [salt.state       ][INFO    ][27526] Running state [/srv/salt/reclass/classes/service/maas] at time 07:34:43.947685
2018-01-25 07:34:43,947 [salt.state       ][INFO    ][27526] Executing state file.symlink for /srv/salt/reclass/classes/service/maas
2018-01-25 07:34:43,950 [salt.state       ][INFO    ][27526] Symlink /srv/salt/reclass/classes/service/maas is present and owned by root:root
2018-01-25 07:34:43,950 [salt.state       ][INFO    ][27526] Completed state [/srv/salt/reclass/classes/service/maas] at time 07:34:43.950437 duration_in_ms=2.752
2018-01-25 07:34:43,951 [salt.state       ][INFO    ][27526] Running state [/srv/salt/reclass/classes/service/libvirt] at time 07:34:43.951423
2018-01-25 07:34:43,951 [salt.state       ][INFO    ][27526] Executing state file.symlink for /srv/salt/reclass/classes/service/libvirt
2018-01-25 07:34:43,953 [salt.state       ][INFO    ][27526] Symlink /srv/salt/reclass/classes/service/libvirt is present and owned by root:root
2018-01-25 07:34:43,953 [salt.state       ][INFO    ][27526] Completed state [/srv/salt/reclass/classes/service/libvirt] at time 07:34:43.953748 duration_in_ms=2.326
2018-01-25 07:34:43,954 [salt.state       ][INFO    ][27526] Running state [/srv/salt/reclass/classes/service/influxdb] at time 07:34:43.954760
2018-01-25 07:34:43,955 [salt.state       ][INFO    ][27526] Executing state file.symlink for /srv/salt/reclass/classes/service/influxdb
2018-01-25 07:34:43,956 [salt.state       ][INFO    ][27526] Symlink /srv/salt/reclass/classes/service/influxdb is present and owned by root:root
2018-01-25 07:34:43,957 [salt.state       ][INFO    ][27526] Completed state [/srv/salt/reclass/classes/service/influxdb] at time 07:34:43.957010 duration_in_ms=2.25
2018-01-25 07:34:43,958 [salt.state       ][INFO    ][27526] Running state [/srv/salt/reclass/classes/service/heka] at time 07:34:43.958587
2018-01-25 07:34:43,958 [salt.state       ][INFO    ][27526] Executing state file.symlink for /srv/salt/reclass/classes/service/heka
2018-01-25 07:34:43,960 [salt.state       ][INFO    ][27526] Symlink /srv/salt/reclass/classes/service/heka is present and owned by root:root
2018-01-25 07:34:43,960 [salt.state       ][INFO    ][27526] Completed state [/srv/salt/reclass/classes/service/heka] at time 07:34:43.960817 duration_in_ms=2.23
2018-01-25 07:34:43,962 [salt.state       ][INFO    ][27526] Running state [/srv/salt/reclass/classes/service/heat] at time 07:34:43.962362
2018-01-25 07:34:43,962 [salt.state       ][INFO    ][27526] Executing state file.symlink for /srv/salt/reclass/classes/service/heat
2018-01-25 07:34:43,964 [salt.state       ][INFO    ][27526] Symlink /srv/salt/reclass/classes/service/heat is present and owned by root:root
2018-01-25 07:34:43,964 [salt.state       ][INFO    ][27526] Completed state [/srv/salt/reclass/classes/service/heat] at time 07:34:43.964584 duration_in_ms=2.222
2018-01-25 07:34:43,965 [salt.state       ][INFO    ][27526] Running state [/srv/salt/reclass/classes/service/openldap] at time 07:34:43.965587
2018-01-25 07:34:43,965 [salt.state       ][INFO    ][27526] Executing state file.symlink for /srv/salt/reclass/classes/service/openldap
2018-01-25 07:34:43,967 [salt.state       ][INFO    ][27526] Symlink /srv/salt/reclass/classes/service/openldap is present and owned by root:root
2018-01-25 07:34:43,967 [salt.state       ][INFO    ][27526] Completed state [/srv/salt/reclass/classes/service/openldap] at time 07:34:43.967809 duration_in_ms=2.222
2018-01-25 07:34:43,968 [salt.state       ][INFO    ][27526] Running state [/srv/salt/reclass/classes/service/kibana] at time 07:34:43.968795
2018-01-25 07:34:43,969 [salt.state       ][INFO    ][27526] Executing state file.symlink for /srv/salt/reclass/classes/service/kibana
2018-01-25 07:34:43,971 [salt.state       ][INFO    ][27526] Symlink /srv/salt/reclass/classes/service/kibana is present and owned by root:root
2018-01-25 07:34:43,971 [salt.state       ][INFO    ][27526] Completed state [/srv/salt/reclass/classes/service/kibana] at time 07:34:43.971302 duration_in_ms=2.506
2018-01-25 07:34:43,972 [salt.state       ][INFO    ][27526] Running state [/srv/salt/reclass/classes/service/avinetworks] at time 07:34:43.972323
2018-01-25 07:34:43,972 [salt.state       ][INFO    ][27526] Executing state file.symlink for /srv/salt/reclass/classes/service/avinetworks
2018-01-25 07:34:43,974 [salt.state       ][INFO    ][27526] Symlink /srv/salt/reclass/classes/service/avinetworks is present and owned by root:root
2018-01-25 07:34:43,974 [salt.state       ][INFO    ][27526] Completed state [/srv/salt/reclass/classes/service/avinetworks] at time 07:34:43.974813 duration_in_ms=2.489
2018-01-25 07:34:43,975 [salt.state       ][INFO    ][27526] Running state [/srv/salt/reclass/classes/service/sphinx] at time 07:34:43.975853
2018-01-25 07:34:43,976 [salt.state       ][INFO    ][27526] Executing state file.symlink for /srv/salt/reclass/classes/service/sphinx
2018-01-25 07:34:43,977 [salt.state       ][INFO    ][27526] Symlink /srv/salt/reclass/classes/service/sphinx is present and owned by root:root
2018-01-25 07:34:43,978 [salt.state       ][INFO    ][27526] Completed state [/srv/salt/reclass/classes/service/sphinx] at time 07:34:43.978043 duration_in_ms=2.19
2018-01-25 07:34:43,979 [salt.state       ][INFO    ][27526] Running state [/srv/salt/reclass/classes/service/prometheus] at time 07:34:43.979038
2018-01-25 07:34:43,979 [salt.state       ][INFO    ][27526] Executing state file.symlink for /srv/salt/reclass/classes/service/prometheus
2018-01-25 07:34:43,981 [salt.state       ][INFO    ][27526] Symlink /srv/salt/reclass/classes/service/prometheus is present and owned by root:root
2018-01-25 07:34:43,981 [salt.state       ][INFO    ][27526] Completed state [/srv/salt/reclass/classes/service/prometheus] at time 07:34:43.981268 duration_in_ms=2.229
2018-01-25 07:34:43,982 [salt.state       ][INFO    ][27526] Running state [/srv/salt/reclass/classes/service/swift] at time 07:34:43.982843
2018-01-25 07:34:43,983 [salt.state       ][INFO    ][27526] Executing state file.symlink for /srv/salt/reclass/classes/service/swift
2018-01-25 07:34:43,985 [salt.state       ][INFO    ][27526] Symlink /srv/salt/reclass/classes/service/swift is present and owned by root:root
2018-01-25 07:34:43,985 [salt.state       ][INFO    ][27526] Completed state [/srv/salt/reclass/classes/service/swift] at time 07:34:43.985377 duration_in_ms=2.534
2018-01-25 07:34:43,986 [salt.state       ][INFO    ][27526] Running state [/srv/salt/reclass/classes/service/billometer] at time 07:34:43.986364
2018-01-25 07:34:43,986 [salt.state       ][INFO    ][27526] Executing state file.symlink for /srv/salt/reclass/classes/service/billometer
2018-01-25 07:34:43,988 [salt.state       ][INFO    ][27526] Symlink /srv/salt/reclass/classes/service/billometer is present and owned by root:root
2018-01-25 07:34:43,988 [salt.state       ][INFO    ][27526] Completed state [/srv/salt/reclass/classes/service/billometer] at time 07:34:43.988573 duration_in_ms=2.208
2018-01-25 07:34:43,989 [salt.state       ][INFO    ][27526] Running state [/srv/salt/reclass/classes/service/haproxy] at time 07:34:43.989584
2018-01-25 07:34:43,989 [salt.state       ][INFO    ][27526] Executing state file.symlink for /srv/salt/reclass/classes/service/haproxy
2018-01-25 07:34:43,991 [salt.state       ][INFO    ][27526] Symlink /srv/salt/reclass/classes/service/haproxy is present and owned by root:root
2018-01-25 07:34:43,991 [salt.state       ][INFO    ][27526] Completed state [/srv/salt/reclass/classes/service/haproxy] at time 07:34:43.991816 duration_in_ms=2.232
2018-01-25 07:34:43,992 [salt.state       ][INFO    ][27526] Running state [/srv/salt/reclass/classes/service/ceilometer] at time 07:34:43.992809
2018-01-25 07:34:43,993 [salt.state       ][INFO    ][27526] Executing state file.symlink for /srv/salt/reclass/classes/service/ceilometer
2018-01-25 07:34:43,995 [salt.state       ][INFO    ][27526] Symlink /srv/salt/reclass/classes/service/ceilometer is present and owned by root:root
2018-01-25 07:34:43,995 [salt.state       ][INFO    ][27526] Completed state [/srv/salt/reclass/classes/service/ceilometer] at time 07:34:43.995284 duration_in_ms=2.475
2018-01-25 07:34:43,996 [salt.state       ][INFO    ][27526] Running state [/srv/salt/reclass/classes/service/aptcacher] at time 07:34:43.996321
2018-01-25 07:34:43,996 [salt.state       ][INFO    ][27526] Executing state file.symlink for /srv/salt/reclass/classes/service/aptcacher
2018-01-25 07:34:43,998 [salt.state       ][INFO    ][27526] Symlink /srv/salt/reclass/classes/service/aptcacher is present and owned by root:root
2018-01-25 07:34:43,998 [salt.state       ][INFO    ][27526] Completed state [/srv/salt/reclass/classes/service/aptcacher] at time 07:34:43.998529 duration_in_ms=2.208
2018-01-25 07:34:43,999 [salt.state       ][INFO    ][27526] Running state [/srv/salt/reclass/classes/service/nginx] at time 07:34:43.999558
2018-01-25 07:34:43,999 [salt.state       ][INFO    ][27526] Executing state file.symlink for /srv/salt/reclass/classes/service/nginx
2018-01-25 07:34:44,001 [salt.state       ][INFO    ][27526] Symlink /srv/salt/reclass/classes/service/nginx is present and owned by root:root
2018-01-25 07:34:44,001 [salt.state       ][INFO    ][27526] Completed state [/srv/salt/reclass/classes/service/nginx] at time 07:34:44.001760 duration_in_ms=2.202
2018-01-25 07:34:44,002 [salt.state       ][INFO    ][27526] Running state [/srv/salt/reclass/classes/service/bind] at time 07:34:44.002741
2018-01-25 07:34:44,003 [salt.state       ][INFO    ][27526] Executing state file.symlink for /srv/salt/reclass/classes/service/bind
2018-01-25 07:34:44,004 [salt.state       ][INFO    ][27526] Symlink /srv/salt/reclass/classes/service/bind is present and owned by root:root
2018-01-25 07:34:44,004 [salt.state       ][INFO    ][27526] Completed state [/srv/salt/reclass/classes/service/bind] at time 07:34:44.004947 duration_in_ms=2.206
2018-01-25 07:34:44,006 [salt.state       ][INFO    ][27526] Running state [/srv/salt/reclass/classes/service/redis] at time 07:34:44.006243
2018-01-25 07:34:44,006 [salt.state       ][INFO    ][27526] Executing state file.symlink for /srv/salt/reclass/classes/service/redis
2018-01-25 07:34:44,008 [salt.state       ][INFO    ][27526] Symlink /srv/salt/reclass/classes/service/redis is present and owned by root:root
2018-01-25 07:34:44,008 [salt.state       ][INFO    ][27526] Completed state [/srv/salt/reclass/classes/service/redis] at time 07:34:44.008431 duration_in_ms=2.188
2018-01-25 07:34:44,009 [salt.state       ][INFO    ][27526] Running state [/srv/salt/reclass/classes/service/opencontrail] at time 07:34:44.009425
2018-01-25 07:34:44,009 [salt.state       ][INFO    ][27526] Executing state file.symlink for /srv/salt/reclass/classes/service/opencontrail
2018-01-25 07:34:44,011 [salt.state       ][INFO    ][27526] Symlink /srv/salt/reclass/classes/service/opencontrail is present and owned by root:root
2018-01-25 07:34:44,011 [salt.state       ][INFO    ][27526] Completed state [/srv/salt/reclass/classes/service/opencontrail] at time 07:34:44.011679 duration_in_ms=2.254
2018-01-25 07:34:44,012 [salt.state       ][INFO    ][27526] Running state [/srv/salt/reclass/classes/service/ccp] at time 07:34:44.012661
2018-01-25 07:34:44,012 [salt.state       ][INFO    ][27526] Executing state file.symlink for /srv/salt/reclass/classes/service/ccp
2018-01-25 07:34:44,014 [salt.state       ][INFO    ][27526] Symlink /srv/salt/reclass/classes/service/ccp is present and owned by root:root
2018-01-25 07:34:44,014 [salt.state       ][INFO    ][27526] Completed state [/srv/salt/reclass/classes/service/ccp] at time 07:34:44.014832 duration_in_ms=2.171
2018-01-25 07:34:44,015 [salt.state       ][INFO    ][27526] Running state [/srv/salt/reclass/classes/service/rabbitmq] at time 07:34:44.015848
2018-01-25 07:34:44,016 [salt.state       ][INFO    ][27526] Executing state file.symlink for /srv/salt/reclass/classes/service/rabbitmq
2018-01-25 07:34:44,017 [salt.state       ][INFO    ][27526] Symlink /srv/salt/reclass/classes/service/rabbitmq is present and owned by root:root
2018-01-25 07:34:44,018 [salt.state       ][INFO    ][27526] Completed state [/srv/salt/reclass/classes/service/rabbitmq] at time 07:34:44.018057 duration_in_ms=2.209
2018-01-25 07:34:44,019 [salt.state       ][INFO    ][27526] Running state [/srv/salt/reclass/classes/service/octavia] at time 07:34:44.019033
2018-01-25 07:34:44,019 [salt.state       ][INFO    ][27526] Executing state file.symlink for /srv/salt/reclass/classes/service/octavia
2018-01-25 07:34:44,021 [salt.state       ][INFO    ][27526] Symlink /srv/salt/reclass/classes/service/octavia is present and owned by root:root
2018-01-25 07:34:44,021 [salt.state       ][INFO    ][27526] Completed state [/srv/salt/reclass/classes/service/octavia] at time 07:34:44.021251 duration_in_ms=2.218
2018-01-25 07:34:44,022 [salt.state       ][INFO    ][27526] Running state [/srv/salt/reclass/classes/service/elasticsearch] at time 07:34:44.022529
2018-01-25 07:34:44,022 [salt.state       ][INFO    ][27526] Executing state file.symlink for /srv/salt/reclass/classes/service/elasticsearch
2018-01-25 07:34:44,024 [salt.state       ][INFO    ][27526] Symlink /srv/salt/reclass/classes/service/elasticsearch is present and owned by root:root
2018-01-25 07:34:44,024 [salt.state       ][INFO    ][27526] Completed state [/srv/salt/reclass/classes/service/elasticsearch] at time 07:34:44.024722 duration_in_ms=2.193
2018-01-25 07:34:44,026 [salt.state       ][INFO    ][27526] Running state [/srv/salt/reclass/classes/service/graphite] at time 07:34:44.026269
2018-01-25 07:34:44,026 [salt.state       ][INFO    ][27526] Executing state file.symlink for /srv/salt/reclass/classes/service/graphite
2018-01-25 07:34:44,028 [salt.state       ][INFO    ][27526] Symlink /srv/salt/reclass/classes/service/graphite is present and owned by root:root
2018-01-25 07:34:44,028 [salt.state       ][INFO    ][27526] Completed state [/srv/salt/reclass/classes/service/graphite] at time 07:34:44.028472 duration_in_ms=2.202
2018-01-25 07:34:44,029 [salt.state       ][INFO    ][27526] Running state [/srv/salt/reclass/classes/service/postgresql] at time 07:34:44.029478
2018-01-25 07:34:44,029 [salt.state       ][INFO    ][27526] Executing state file.symlink for /srv/salt/reclass/classes/service/postgresql
2018-01-25 07:34:44,031 [salt.state       ][INFO    ][27526] Symlink /srv/salt/reclass/classes/service/postgresql is present and owned by root:root
2018-01-25 07:34:44,031 [salt.state       ][INFO    ][27526] Completed state [/srv/salt/reclass/classes/service/postgresql] at time 07:34:44.031707 duration_in_ms=2.229
2018-01-25 07:34:44,032 [salt.state       ][INFO    ][27526] Running state [/srv/salt/reclass/classes/service/horizon] at time 07:34:44.032691
2018-01-25 07:34:44,032 [salt.state       ][INFO    ][27526] Executing state file.symlink for /srv/salt/reclass/classes/service/horizon
2018-01-25 07:34:44,035 [salt.state       ][INFO    ][27526] Symlink /srv/salt/reclass/classes/service/horizon is present and owned by root:root
2018-01-25 07:34:44,035 [salt.state       ][INFO    ][27526] Completed state [/srv/salt/reclass/classes/service/horizon] at time 07:34:44.035415 duration_in_ms=2.724
2018-01-25 07:34:44,036 [salt.state       ][INFO    ][27526] Running state [/srv/salt/reclass/classes/service/openssh] at time 07:34:44.036451
2018-01-25 07:34:44,036 [salt.state       ][INFO    ][27526] Executing state file.symlink for /srv/salt/reclass/classes/service/openssh
2018-01-25 07:34:44,038 [salt.state       ][INFO    ][27526] Symlink /srv/salt/reclass/classes/service/openssh is present and owned by root:root
2018-01-25 07:34:44,038 [salt.state       ][INFO    ][27526] Completed state [/srv/salt/reclass/classes/service/openssh] at time 07:34:44.038921 duration_in_ms=2.469
2018-01-25 07:34:44,039 [salt.state       ][INFO    ][27526] Running state [/srv/salt/reclass/classes/service/cinder] at time 07:34:44.039942
2018-01-25 07:34:44,040 [salt.state       ][INFO    ][27526] Executing state file.symlink for /srv/salt/reclass/classes/service/cinder
2018-01-25 07:34:44,042 [salt.state       ][INFO    ][27526] Symlink /srv/salt/reclass/classes/service/cinder is present and owned by root:root
2018-01-25 07:34:44,042 [salt.state       ][INFO    ][27526] Completed state [/srv/salt/reclass/classes/service/cinder] at time 07:34:44.042424 duration_in_ms=2.482
2018-01-25 07:34:44,043 [salt.state       ][INFO    ][27526] Running state [/srv/salt/reclass/classes/service/docker] at time 07:34:44.043412
2018-01-25 07:34:44,043 [salt.state       ][INFO    ][27526] Executing state file.symlink for /srv/salt/reclass/classes/service/docker
2018-01-25 07:34:44,045 [salt.state       ][INFO    ][27526] Symlink /srv/salt/reclass/classes/service/docker is present and owned by root:root
2018-01-25 07:34:44,045 [salt.state       ][INFO    ][27526] Completed state [/srv/salt/reclass/classes/service/docker] at time 07:34:44.045680 duration_in_ms=2.268
2018-01-25 07:34:44,046 [salt.state       ][INFO    ][27526] Running state [/srv/salt/reclass/classes/service/salt] at time 07:34:44.046670
2018-01-25 07:34:44,046 [salt.state       ][INFO    ][27526] Executing state file.symlink for /srv/salt/reclass/classes/service/salt
2018-01-25 07:34:44,049 [salt.state       ][INFO    ][27526] Symlink /srv/salt/reclass/classes/service/salt is present and owned by root:root
2018-01-25 07:34:44,049 [salt.state       ][INFO    ][27526] Completed state [/srv/salt/reclass/classes/service/salt] at time 07:34:44.049210 duration_in_ms=2.539
2018-01-25 07:34:44,050 [salt.state       ][INFO    ][27526] Running state [/srv/salt/reclass/classes/service/devops_portal] at time 07:34:44.050504
2018-01-25 07:34:44,050 [salt.state       ][INFO    ][27526] Executing state file.symlink for /srv/salt/reclass/classes/service/devops_portal
2018-01-25 07:34:44,052 [salt.state       ][INFO    ][27526] Symlink /srv/salt/reclass/classes/service/devops_portal is present and owned by root:root
2018-01-25 07:34:44,052 [salt.state       ][INFO    ][27526] Completed state [/srv/salt/reclass/classes/service/devops_portal] at time 07:34:44.052819 duration_in_ms=2.315
2018-01-25 07:34:44,053 [salt.state       ][INFO    ][27526] Running state [salt-minion] at time 07:34:44.053093
2018-01-25 07:34:44,053 [salt.state       ][INFO    ][27526] Executing state pkg.installed for salt-minion
2018-01-25 07:34:44,061 [salt.state       ][INFO    ][27526] All specified packages are already installed
2018-01-25 07:34:44,062 [salt.state       ][INFO    ][27526] Completed state [salt-minion] at time 07:34:44.062196 duration_in_ms=9.103
2018-01-25 07:34:44,062 [salt.state       ][INFO    ][27526] Running state [salt_minion_dependency_packages] at time 07:34:44.062449
2018-01-25 07:34:44,062 [salt.state       ][INFO    ][27526] Executing state pkg.installed for salt_minion_dependency_packages
2018-01-25 07:34:44,069 [salt.state       ][INFO    ][27526] All specified packages are already installed
2018-01-25 07:34:44,070 [salt.state       ][INFO    ][27526] Completed state [salt_minion_dependency_packages] at time 07:34:44.069983 duration_in_ms=7.534
2018-01-25 07:34:44,071 [salt.state       ][INFO    ][27526] Running state [/etc/salt/minion.d/minion.conf] at time 07:34:44.071223
2018-01-25 07:34:44,071 [salt.state       ][INFO    ][27526] Executing state file.managed for /etc/salt/minion.d/minion.conf
2018-01-25 07:34:44,290 [salt.state       ][INFO    ][27526] File /etc/salt/minion.d/minion.conf is in the correct state
2018-01-25 07:34:44,290 [salt.state       ][INFO    ][27526] Completed state [/etc/salt/minion.d/minion.conf] at time 07:34:44.290370 duration_in_ms=219.146
2018-01-25 07:34:44,291 [salt.state       ][INFO    ][27526] Running state [/etc/salt/minion.d/_pki.conf] at time 07:34:44.291403
2018-01-25 07:34:44,291 [salt.state       ][INFO    ][27526] Executing state file.managed for /etc/salt/minion.d/_pki.conf
2018-01-25 07:34:44,292 [salt.state       ][INFO    ][27526] File /etc/salt/minion.d/_pki.conf is in the correct state
2018-01-25 07:34:44,293 [salt.state       ][INFO    ][27526] Completed state [/etc/salt/minion.d/_pki.conf] at time 07:34:44.293031 duration_in_ms=1.628
2018-01-25 07:34:44,297 [salt.state       ][INFO    ][27526] Running state [salt-minion] at time 07:34:44.297081
2018-01-25 07:34:44,297 [salt.state       ][INFO    ][27526] Executing state service.running for salt-minion
2018-01-25 07:34:44,297 [salt.loaded.int.module.cmdmod][INFO    ][27526] Executing command ['systemctl', 'status', 'salt-minion.service', '-n', '0'] in directory '/root'
2018-01-25 07:34:44,315 [salt.loaded.int.module.cmdmod][INFO    ][27526] Executing command ['systemctl', 'is-active', 'salt-minion.service'] in directory '/root'
2018-01-25 07:34:44,328 [salt.loaded.int.module.cmdmod][INFO    ][27526] Executing command ['systemctl', 'is-enabled', 'salt-minion.service'] in directory '/root'
2018-01-25 07:34:44,340 [salt.state       ][INFO    ][27526] The service salt-minion is already running
2018-01-25 07:34:44,341 [salt.state       ][INFO    ][27526] Completed state [salt-minion] at time 07:34:44.341197 duration_in_ms=44.114
2018-01-25 07:34:44,346 [salt.state       ][INFO    ][27526] Running state [/etc/salt/grains.d] at time 07:34:44.346256
2018-01-25 07:34:44,346 [salt.state       ][INFO    ][27526] Executing state file.directory for /etc/salt/grains.d
2018-01-25 07:34:44,347 [salt.state       ][INFO    ][27526] Directory /etc/salt/grains.d is in the correct state
2018-01-25 07:34:44,347 [salt.state       ][INFO    ][27526] Completed state [/etc/salt/grains.d] at time 07:34:44.347784 duration_in_ms=1.528
2018-01-25 07:34:44,349 [salt.state       ][INFO    ][27526] Running state [/etc/salt/grains] at time 07:34:44.348953
2018-01-25 07:34:44,349 [salt.state       ][INFO    ][27526] Executing state file.managed for /etc/salt/grains
2018-01-25 07:34:44,349 [salt.state       ][INFO    ][27526] File /etc/salt/grains exists with proper permissions. No changes made.
2018-01-25 07:34:44,350 [salt.state       ][INFO    ][27526] Completed state [/etc/salt/grains] at time 07:34:44.349954 duration_in_ms=1.001
2018-01-25 07:34:44,350 [salt.state       ][INFO    ][27526] Running state [/etc/salt/grains.d/placeholder] at time 07:34:44.350913
2018-01-25 07:34:44,351 [salt.state       ][INFO    ][27526] Executing state file.managed for /etc/salt/grains.d/placeholder
2018-01-25 07:34:44,351 [salt.state       ][INFO    ][27526] File /etc/salt/grains.d/placeholder exists with proper permissions. No changes made.
2018-01-25 07:34:44,351 [salt.state       ][INFO    ][27526] Completed state [/etc/salt/grains.d/placeholder] at time 07:34:44.351884 duration_in_ms=0.971
2018-01-25 07:34:44,352 [salt.state       ][INFO    ][27526] Running state [/etc/salt/grains.d/sphinx] at time 07:34:44.352856
2018-01-25 07:34:44,353 [salt.state       ][INFO    ][27526] Executing state file.managed for /etc/salt/grains.d/sphinx
2018-01-25 07:34:44,355 [salt.state       ][INFO    ][27526] File /etc/salt/grains.d/sphinx is in the correct state
2018-01-25 07:34:44,355 [salt.state       ][INFO    ][27526] Completed state [/etc/salt/grains.d/sphinx] at time 07:34:44.355607 duration_in_ms=2.751
2018-01-25 07:34:44,358 [salt.state       ][INFO    ][27526] Running state [python -c "import yaml; stream = file('/etc/salt/grains.d/sphinx', 'r'); yaml.load(stream); stream.close()"] at time 07:34:44.358195
2018-01-25 07:34:44,358 [salt.state       ][INFO    ][27526] Executing state cmd.wait for python -c "import yaml; stream = file('/etc/salt/grains.d/sphinx', 'r'); yaml.load(stream); stream.close()"
2018-01-25 07:34:44,358 [salt.state       ][INFO    ][27526] No changes made for python -c "import yaml; stream = file('/etc/salt/grains.d/sphinx', 'r'); yaml.load(stream); stream.close()"
2018-01-25 07:34:44,359 [salt.state       ][INFO    ][27526] Completed state [python -c "import yaml; stream = file('/etc/salt/grains.d/sphinx', 'r'); yaml.load(stream); stream.close()"] at time 07:34:44.359010 duration_in_ms=0.815
2018-01-25 07:34:44,360 [salt.state       ][INFO    ][27526] Running state [/etc/salt/grains.d/dns_records] at time 07:34:44.360012
2018-01-25 07:34:44,360 [salt.state       ][INFO    ][27526] Executing state file.managed for /etc/salt/grains.d/dns_records
2018-01-25 07:34:44,361 [salt.state       ][INFO    ][27526] File /etc/salt/grains.d/dns_records is in the correct state
2018-01-25 07:34:44,361 [salt.state       ][INFO    ][27526] Completed state [/etc/salt/grains.d/dns_records] at time 07:34:44.361494 duration_in_ms=1.482
2018-01-25 07:34:44,363 [salt.state       ][INFO    ][27526] Running state [python -c "import yaml; stream = file('/etc/salt/grains.d/dns_records', 'r'); yaml.load(stream); stream.close()"] at time 07:34:44.363412
2018-01-25 07:34:44,363 [salt.state       ][INFO    ][27526] Executing state cmd.wait for python -c "import yaml; stream = file('/etc/salt/grains.d/dns_records', 'r'); yaml.load(stream); stream.close()"
2018-01-25 07:34:44,364 [salt.state       ][INFO    ][27526] No changes made for python -c "import yaml; stream = file('/etc/salt/grains.d/dns_records', 'r'); yaml.load(stream); stream.close()"
2018-01-25 07:34:44,364 [salt.state       ][INFO    ][27526] Completed state [python -c "import yaml; stream = file('/etc/salt/grains.d/dns_records', 'r'); yaml.load(stream); stream.close()"] at time 07:34:44.364236 duration_in_ms=0.824
2018-01-25 07:34:44,365 [salt.state       ][INFO    ][27526] Running state [/etc/salt/grains.d/salt] at time 07:34:44.365199
2018-01-25 07:34:44,365 [salt.state       ][INFO    ][27526] Executing state file.managed for /etc/salt/grains.d/salt
2018-01-25 07:34:44,366 [salt.state       ][INFO    ][27526] File /etc/salt/grains.d/salt is in the correct state
2018-01-25 07:34:44,366 [salt.state       ][INFO    ][27526] Completed state [/etc/salt/grains.d/salt] at time 07:34:44.366942 duration_in_ms=1.743
2018-01-25 07:34:44,368 [salt.state       ][INFO    ][27526] Running state [python -c "import yaml; stream = file('/etc/salt/grains.d/salt', 'r'); yaml.load(stream); stream.close()"] at time 07:34:44.368847
2018-01-25 07:34:44,369 [salt.state       ][INFO    ][27526] Executing state cmd.wait for python -c "import yaml; stream = file('/etc/salt/grains.d/salt', 'r'); yaml.load(stream); stream.close()"
2018-01-25 07:34:44,369 [salt.state       ][INFO    ][27526] No changes made for python -c "import yaml; stream = file('/etc/salt/grains.d/salt', 'r'); yaml.load(stream); stream.close()"
2018-01-25 07:34:44,369 [salt.state       ][INFO    ][27526] Completed state [python -c "import yaml; stream = file('/etc/salt/grains.d/salt', 'r'); yaml.load(stream); stream.close()"] at time 07:34:44.369923 duration_in_ms=1.076
2018-01-25 07:34:44,373 [salt.state       ][INFO    ][27526] Running state [cat /etc/salt/grains.d/* > /etc/salt/grains] at time 07:34:44.373455
2018-01-25 07:34:44,373 [salt.state       ][INFO    ][27526] Executing state cmd.wait for cat /etc/salt/grains.d/* > /etc/salt/grains
2018-01-25 07:34:44,374 [salt.state       ][INFO    ][27526] No changes made for cat /etc/salt/grains.d/* > /etc/salt/grains
2018-01-25 07:34:44,374 [salt.state       ][INFO    ][27526] Completed state [cat /etc/salt/grains.d/* > /etc/salt/grains] at time 07:34:44.374237 duration_in_ms=0.782
2018-01-25 07:34:44,375 [salt.state       ][INFO    ][27526] Running state [mine.update] at time 07:34:44.375381
2018-01-25 07:34:44,375 [salt.state       ][INFO    ][27526] Executing state module.wait for mine.update
2018-01-25 07:34:44,375 [salt.state       ][INFO    ][27526] No changes made for mine.update
2018-01-25 07:34:44,376 [salt.state       ][INFO    ][27526] Completed state [mine.update] at time 07:34:44.376136 duration_in_ms=0.755
2018-01-25 07:34:44,376 [salt.state       ][INFO    ][27526] Running state [/etc/pki/ca/salt_master_ca] at time 07:34:44.376365
2018-01-25 07:34:44,376 [salt.state       ][INFO    ][27526] Executing state file.directory for /etc/pki/ca/salt_master_ca
2018-01-25 07:34:44,377 [salt.state       ][INFO    ][27526] Directory /etc/pki/ca/salt_master_ca is in the correct state
2018-01-25 07:34:44,377 [salt.state       ][INFO    ][27526] Completed state [/etc/pki/ca/salt_master_ca] at time 07:34:44.377709 duration_in_ms=1.344
2018-01-25 07:34:44,377 [salt.state       ][INFO    ][27526] Running state [/etc/pki/ca/salt_master_ca/certs] at time 07:34:44.377942
2018-01-25 07:34:44,378 [salt.state       ][INFO    ][27526] Executing state file.directory for /etc/pki/ca/salt_master_ca/certs
2018-01-25 07:34:44,378 [salt.state       ][INFO    ][27526] Directory /etc/pki/ca/salt_master_ca/certs is in the correct state
2018-01-25 07:34:44,378 [salt.state       ][INFO    ][27526] Completed state [/etc/pki/ca/salt_master_ca/certs] at time 07:34:44.378935 duration_in_ms=0.993
2018-01-25 07:34:44,380 [salt.state       ][INFO    ][27526] Running state [/etc/pki/ca/salt_master_ca/ca.key] at time 07:34:44.380721
2018-01-25 07:34:44,381 [salt.state       ][INFO    ][27526] Executing state x509.private_key_managed for /etc/pki/ca/salt_master_ca/ca.key
2018-01-25 07:34:44,384 [salt.state       ][INFO    ][27526] File /etc/pki/ca/salt_master_ca/ca.key is in the correct state
2018-01-25 07:34:44,385 [salt.state       ][INFO    ][27526] Completed state [/etc/pki/ca/salt_master_ca/ca.key] at time 07:34:44.385007 duration_in_ms=4.286
2018-01-25 07:34:44,386 [salt.state       ][INFO    ][27526] Running state [/etc/pki/ca/salt_master_ca/ca.key] at time 07:34:44.386214
2018-01-25 07:34:44,386 [salt.state       ][INFO    ][27526] Executing state file.managed for /etc/pki/ca/salt_master_ca/ca.key
2018-01-25 07:34:44,387 [salt.state       ][INFO    ][27526] File /etc/pki/ca/salt_master_ca/ca.key exists with proper permissions. No changes made.
2018-01-25 07:34:44,387 [salt.state       ][INFO    ][27526] Completed state [/etc/pki/ca/salt_master_ca/ca.key] at time 07:34:44.387489 duration_in_ms=1.275
2018-01-25 07:34:44,388 [salt.state       ][INFO    ][27526] Running state [/etc/pki/ca/salt_master_ca/ca.crt] at time 07:34:44.388455
2018-01-25 07:34:44,388 [salt.state       ][INFO    ][27526] Executing state x509.certificate_managed for /etc/pki/ca/salt_master_ca/ca.crt
2018-01-25 07:34:44,398 [salt.state       ][INFO    ][27526] File /etc/pki/ca/salt_master_ca/ca.crt is in the correct state
2018-01-25 07:34:44,398 [salt.state       ][INFO    ][27526] Completed state [/etc/pki/ca/salt_master_ca/ca.crt] at time 07:34:44.398627 duration_in_ms=10.172
2018-01-25 07:34:44,399 [salt.state       ][INFO    ][27526] Running state [/etc/pki/ca/salt_master_ca/ca.crt] at time 07:34:44.399865
2018-01-25 07:34:44,400 [salt.state       ][INFO    ][27526] Executing state file.managed for /etc/pki/ca/salt_master_ca/ca.crt
2018-01-25 07:34:44,400 [salt.loaded.int.states.file][WARNING ][27526] 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.
2018-01-25 07:34:44,401 [salt.state       ][INFO    ][27526] File /etc/pki/ca/salt_master_ca/ca.crt exists with proper permissions. No changes made.
2018-01-25 07:34:44,401 [salt.state       ][INFO    ][27526] Completed state [/etc/pki/ca/salt_master_ca/ca.crt] at time 07:34:44.401306 duration_in_ms=1.441
2018-01-25 07:34:44,402 [salt.state       ][INFO    ][27526] Running state [mine.send] at time 07:34:44.402581
2018-01-25 07:34:44,402 [salt.state       ][INFO    ][27526] Executing state module.run for mine.send
2018-01-25 07:34:44,908 [salt.state       ][INFO    ][27526] {'ret': True}
2018-01-25 07:34:44,910 [salt.state       ][INFO    ][27526] Completed state [mine.send] at time 07:34:44.909284 duration_in_ms=506.702
2018-01-25 07:34:44,911 [salt.state       ][INFO    ][27526] Running state [ca-certificates] at time 07:34:44.911125
2018-01-25 07:34:44,911 [salt.state       ][INFO    ][27526] Executing state pkg.installed for ca-certificates
2018-01-25 07:34:44,922 [salt.state       ][INFO    ][27526] All specified packages are already installed
2018-01-25 07:34:44,922 [salt.state       ][INFO    ][27526] Completed state [ca-certificates] at time 07:34:44.922704 duration_in_ms=11.579
2018-01-25 07:34:44,924 [salt.state       ][INFO    ][27526] Running state [update-ca-certificates] at time 07:34:44.924475
2018-01-25 07:34:44,924 [salt.state       ][INFO    ][27526] Executing state cmd.wait for update-ca-certificates
2018-01-25 07:34:44,925 [salt.state       ][INFO    ][27526] No changes made for update-ca-certificates
2018-01-25 07:34:44,925 [salt.state       ][INFO    ][27526] Completed state [update-ca-certificates] at time 07:34:44.925789 duration_in_ms=1.315
2018-01-25 07:34:44,926 [salt.state       ][INFO    ][27526] Running state [salt-api] at time 07:34:44.926121
2018-01-25 07:34:44,926 [salt.state       ][INFO    ][27526] Executing state pkg.installed for salt-api
2018-01-25 07:34:44,933 [salt.state       ][INFO    ][27526] All specified packages are already installed
2018-01-25 07:34:44,934 [salt.state       ][INFO    ][27526] Completed state [salt-api] at time 07:34:44.933967 duration_in_ms=7.846
2018-01-25 07:34:44,935 [salt.state       ][INFO    ][27526] Running state [/etc/salt/master.d/_api.conf] at time 07:34:44.935218
2018-01-25 07:34:44,935 [salt.state       ][INFO    ][27526] Executing state file.managed for /etc/salt/master.d/_api.conf
2018-01-25 07:34:45,118 [salt.state       ][INFO    ][27526] File /etc/salt/master.d/_api.conf is in the correct state
2018-01-25 07:34:45,118 [salt.state       ][INFO    ][27526] Completed state [/etc/salt/master.d/_api.conf] at time 07:34:45.118700 duration_in_ms=183.481
2018-01-25 07:34:45,121 [salt.state       ][INFO    ][27526] Running state [salt-api] at time 07:34:45.121704
2018-01-25 07:34:45,122 [salt.state       ][INFO    ][27526] Executing state service.running for salt-api
2018-01-25 07:34:45,122 [salt.loaded.int.module.cmdmod][INFO    ][27526] Executing command ['systemctl', 'status', 'salt-api.service', '-n', '0'] in directory '/root'
2018-01-25 07:34:45,141 [salt.loaded.int.module.cmdmod][INFO    ][27526] Executing command ['systemctl', 'is-active', 'salt-api.service'] in directory '/root'
2018-01-25 07:34:45,154 [salt.loaded.int.module.cmdmod][INFO    ][27526] Executing command ['systemctl', 'is-enabled', 'salt-api.service'] in directory '/root'
2018-01-25 07:34:45,167 [salt.state       ][INFO    ][27526] The service salt-api is already running
2018-01-25 07:34:45,168 [salt.state       ][INFO    ][27526] Completed state [salt-api] at time 07:34:45.167948 duration_in_ms=46.244
2018-01-25 07:34:45,177 [salt.minion      ][INFO    ][27526] Returning information for job: 20180125073428055333
2018-01-25 07:34:45,974 [salt.minion      ][INFO    ][27383] User sudo_ubuntu Executing command state.apply with jid 20180125073445962811
2018-01-25 07:34:45,995 [salt.minion      ][INFO    ][27929] Starting a new job with PID 27929
2018-01-25 07:34:48,461 [salt.state       ][INFO    ][27929] Loading fresh modules for state activity
2018-01-25 07:34:48,513 [salt.fileclient  ][INFO    ][27929] Fetching file from saltenv 'base', ** done ** 'linux/init.sls'
2018-01-25 07:34:48,546 [salt.fileclient  ][INFO    ][27929] Fetching file from saltenv 'base', ** done ** 'linux/system/init.sls'
2018-01-25 07:34:48,669 [salt.fileclient  ][INFO    ][27929] Fetching file from saltenv 'base', ** done ** 'linux/system/env.sls'
2018-01-25 07:34:48,767 [salt.fileclient  ][INFO    ][27929] Fetching file from saltenv 'base', ** done ** 'linux/system/profile.sls'
2018-01-25 07:34:48,862 [salt.fileclient  ][INFO    ][27929] Fetching file from saltenv 'base', ** done ** 'linux/system/repo.sls'
2018-01-25 07:34:49,057 [salt.fileclient  ][INFO    ][27929] Fetching file from saltenv 'base', ** done ** 'linux/system/package.sls'
2018-01-25 07:34:49,170 [salt.fileclient  ][INFO    ][27929] Fetching file from saltenv 'base', ** done ** 'linux/system/timezone.sls'
2018-01-25 07:34:49,262 [salt.fileclient  ][INFO    ][27929] Fetching file from saltenv 'base', ** done ** 'linux/system/kernel.sls'
2018-01-25 07:34:49,408 [salt.fileclient  ][INFO    ][27929] Fetching file from saltenv 'base', ** done ** 'linux/system/cpu.sls'
2018-01-25 07:34:49,507 [salt.fileclient  ][INFO    ][27929] Fetching file from saltenv 'base', ** done ** 'linux/system/sysfs.sls'
2018-01-25 07:34:49,608 [salt.fileclient  ][INFO    ][27929] Fetching file from saltenv 'base', ** done ** 'linux/system/locale.sls'
2018-01-25 07:34:49,928 [salt.fileclient  ][INFO    ][27929] Fetching file from saltenv 'base', ** done ** 'linux/system/limit.sls'
2018-01-25 07:34:50,036 [salt.fileclient  ][INFO    ][27929] Fetching file from saltenv 'base', ** done ** 'linux/system/systemd.sls'
2018-01-25 07:34:50,143 [salt.fileclient  ][INFO    ][27929] Fetching file from saltenv 'base', ** done ** 'linux/system/apt.sls'
2018-01-25 07:34:50,260 [salt.fileclient  ][INFO    ][27929] Fetching file from saltenv 'base', ** done ** 'linux/network/init.sls'
2018-01-25 07:34:50,365 [salt.fileclient  ][INFO    ][27929] Fetching file from saltenv 'base', ** done ** 'linux/network/hostname.sls'
2018-01-25 07:34:50,466 [salt.fileclient  ][INFO    ][27929] Fetching file from saltenv 'base', ** done ** 'linux/network/host.sls'
2018-01-25 07:34:50,634 [salt.fileclient  ][INFO    ][27929] Fetching file from saltenv 'base', ** done ** 'linux/network/interface.sls'
2018-01-25 07:34:50,820 [salt.fileclient  ][INFO    ][27929] Fetching file from saltenv 'base', ** done ** 'linux/network/proxy.sls'
2018-01-25 07:34:50,913 [salt.fileclient  ][INFO    ][27929] Fetching file from saltenv 'base', ** done ** 'linux/storage/init.sls'
2018-01-25 07:34:51,011 [salt.state       ][INFO    ][27929] Running state [/etc/environment] at time 07:34:51.011014
2018-01-25 07:34:51,011 [salt.state       ][INFO    ][27929] Executing state file.blockreplace for /etc/environment
2018-01-25 07:34:51,020 [salt.state       ][INFO    ][27929] 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

2018-01-25 07:34:51,021 [salt.state       ][INFO    ][27929] Completed state [/etc/environment] at time 07:34:51.021808 duration_in_ms=10.795
2018-01-25 07:34:51,022 [salt.state       ][INFO    ][27929] Running state [/etc/profile.d] at time 07:34:51.022113
2018-01-25 07:34:51,022 [salt.state       ][INFO    ][27929] Executing state file.directory for /etc/profile.d
2018-01-25 07:34:51,023 [salt.state       ][INFO    ][27929] Directory /etc/profile.d is in the correct state
2018-01-25 07:34:51,024 [salt.state       ][INFO    ][27929] Completed state [/etc/profile.d] at time 07:34:51.024060 duration_in_ms=1.947
2018-01-25 07:34:51,605 [salt.state       ][INFO    ][27929] Running state [/etc/apt/apt.conf.d/99compression-workaround-salt] at time 07:34:51.605015
2018-01-25 07:34:51,605 [salt.state       ][INFO    ][27929] Executing state file.managed for /etc/apt/apt.conf.d/99compression-workaround-salt
2018-01-25 07:34:51,631 [salt.fileclient  ][INFO    ][27929] Fetching file from saltenv 'base', ** done ** 'linux/files/apt.conf'
2018-01-25 07:34:51,642 [salt.state       ][INFO    ][27929] File changed:
New file
2018-01-25 07:34:51,642 [salt.state       ][INFO    ][27929] Completed state [/etc/apt/apt.conf.d/99compression-workaround-salt] at time 07:34:51.642857 duration_in_ms=37.842
2018-01-25 07:34:51,643 [salt.state       ][INFO    ][27929] Running state [/etc/apt/apt.conf.d/99prefer_ipv4-salt] at time 07:34:51.643115
2018-01-25 07:34:51,643 [salt.state       ][INFO    ][27929] Executing state file.managed for /etc/apt/apt.conf.d/99prefer_ipv4-salt
2018-01-25 07:34:51,659 [salt.state       ][INFO    ][27929] File changed:
New file
2018-01-25 07:34:51,660 [salt.state       ][INFO    ][27929] Completed state [/etc/apt/apt.conf.d/99prefer_ipv4-salt] at time 07:34:51.660500 duration_in_ms=17.385
2018-01-25 07:34:51,662 [salt.state       ][INFO    ][27929] Running state [linux_repo_prereq_pkgs] at time 07:34:51.662336
2018-01-25 07:34:51,662 [salt.state       ][INFO    ][27929] Executing state pkg.installed for linux_repo_prereq_pkgs
2018-01-25 07:34:51,663 [salt.loaded.int.module.cmdmod][INFO    ][27929] Executing command ['dpkg-query', '--showformat', '${Status} ${Package} ${Version} ${Architecture}\n', '-W'] in directory '/root'
2018-01-25 07:34:52,053 [salt.state       ][INFO    ][27929] All specified packages are already installed
2018-01-25 07:34:52,054 [salt.state       ][INFO    ][27929] Completed state [linux_repo_prereq_pkgs] at time 07:34:52.053993 duration_in_ms=391.656
2018-01-25 07:34:52,055 [salt.state       ][INFO    ][27929] Running state [/etc/apt/apt.conf.d/99proxies-salt-saltstack] at time 07:34:52.055817
2018-01-25 07:34:52,056 [salt.state       ][INFO    ][27929] Executing state file.absent for /etc/apt/apt.conf.d/99proxies-salt-saltstack
2018-01-25 07:34:52,056 [salt.state       ][INFO    ][27929] File /etc/apt/apt.conf.d/99proxies-salt-saltstack is not present
2018-01-25 07:34:52,057 [salt.state       ][INFO    ][27929] Completed state [/etc/apt/apt.conf.d/99proxies-salt-saltstack] at time 07:34:52.057103 duration_in_ms=1.286
2018-01-25 07:34:52,057 [salt.state       ][INFO    ][27929] Running state [/etc/apt/preferences.d/saltstack] at time 07:34:52.057420
2018-01-25 07:34:52,058 [salt.state       ][INFO    ][27929] Executing state file.absent for /etc/apt/preferences.d/saltstack
2018-01-25 07:34:52,058 [salt.state       ][INFO    ][27929] {'removed': '/etc/apt/preferences.d/saltstack'}
2018-01-25 07:34:52,058 [salt.state       ][INFO    ][27929] Completed state [/etc/apt/preferences.d/saltstack] at time 07:34:52.058849 duration_in_ms=1.429
2018-01-25 07:34:52,063 [salt.state       ][INFO    ][27929] Running state [deb http://repo.saltstack.com/apt/ubuntu/16.04/amd64/2016.11 xenial main] at time 07:34:52.063405
2018-01-25 07:34:52,063 [salt.state       ][INFO    ][27929] Executing state pkgrepo.managed for deb http://repo.saltstack.com/apt/ubuntu/16.04/amd64/2016.11 xenial main
2018-01-25 07:34:52,365 [salt.loaded.int.module.cmdmod][INFO    ][27929] Executing command ['apt-key', 'add', '/var/cache/salt/minion/extrn_files/base/repo.saltstack.com/apt/ubuntu/16.04/amd64/2016.11/SALTSTACK-GPG-KEY.pub'] in directory '/root'
2018-01-25 07:34:52,526 [salt.loaded.int.module.cmdmod][INFO    ][27929] Executing command ['apt-get', '-q', 'update'] in directory '/root'
2018-01-25 07:34:56,020 [salt.minion      ][INFO    ][27383] User sudo_ubuntu Executing command saltutil.find_job with jid 20180125073456008807
2018-01-25 07:34:56,063 [salt.minion      ][INFO    ][28383] Starting a new job with PID 28383
2018-01-25 07:34:56,092 [salt.minion      ][INFO    ][28383] Returning information for job: 20180125073456008807
2018-01-25 07:34:57,824 [salt.state       ][INFO    ][27929] Configured package repo 'deb http://repo.saltstack.com/apt/ubuntu/16.04/amd64/2016.11 xenial main'
2018-01-25 07:34:57,825 [salt.state       ][INFO    ][27929] Completed state [deb http://repo.saltstack.com/apt/ubuntu/16.04/amd64/2016.11 xenial main] at time 07:34:57.825026 duration_in_ms=5761.62
2018-01-25 07:34:57,825 [salt.state       ][INFO    ][27929] Running state [/etc/apt/apt.conf.d/99proxies-salt-salt] at time 07:34:57.825669
2018-01-25 07:34:57,826 [salt.state       ][INFO    ][27929] Executing state file.absent for /etc/apt/apt.conf.d/99proxies-salt-salt
2018-01-25 07:34:57,827 [salt.state       ][INFO    ][27929] File /etc/apt/apt.conf.d/99proxies-salt-salt is not present
2018-01-25 07:34:57,827 [salt.state       ][INFO    ][27929] Completed state [/etc/apt/apt.conf.d/99proxies-salt-salt] at time 07:34:57.827551 duration_in_ms=1.882
2018-01-25 07:34:57,828 [salt.state       ][INFO    ][27929] Running state [/etc/apt/preferences.d/salt] at time 07:34:57.828038
2018-01-25 07:34:57,828 [salt.state       ][INFO    ][27929] Executing state file.absent for /etc/apt/preferences.d/salt
2018-01-25 07:34:57,829 [salt.state       ][INFO    ][27929] File /etc/apt/preferences.d/salt is not present
2018-01-25 07:34:57,829 [salt.state       ][INFO    ][27929] Completed state [/etc/apt/preferences.d/salt] at time 07:34:57.829519 duration_in_ms=1.481
2018-01-25 07:34:57,830 [salt.state       ][INFO    ][27929] Running state [/etc/apt/sources.list.d/salt.list] at time 07:34:57.830019
2018-01-25 07:34:57,830 [salt.state       ][INFO    ][27929] Executing state file.absent for /etc/apt/sources.list.d/salt.list
2018-01-25 07:34:57,831 [salt.state       ][INFO    ][27929] File /etc/apt/sources.list.d/salt.list is not present
2018-01-25 07:34:57,831 [salt.state       ][INFO    ][27929] Completed state [/etc/apt/sources.list.d/salt.list] at time 07:34:57.831513 duration_in_ms=1.493
2018-01-25 07:34:57,832 [salt.state       ][INFO    ][27929] Running state [/etc/apt/apt.conf.d/99proxies-salt-uca] at time 07:34:57.831998
2018-01-25 07:34:57,832 [salt.state       ][INFO    ][27929] Executing state file.absent for /etc/apt/apt.conf.d/99proxies-salt-uca
2018-01-25 07:34:57,833 [salt.state       ][INFO    ][27929] File /etc/apt/apt.conf.d/99proxies-salt-uca is not present
2018-01-25 07:34:57,833 [salt.state       ][INFO    ][27929] Completed state [/etc/apt/apt.conf.d/99proxies-salt-uca] at time 07:34:57.833487 duration_in_ms=1.489
2018-01-25 07:34:57,834 [salt.state       ][INFO    ][27929] Running state [/etc/apt/preferences.d/uca] at time 07:34:57.834549
2018-01-25 07:34:57,835 [salt.state       ][INFO    ][27929] Executing state file.absent for /etc/apt/preferences.d/uca
2018-01-25 07:34:57,835 [salt.state       ][INFO    ][27929] File /etc/apt/preferences.d/uca is not present
2018-01-25 07:34:57,836 [salt.state       ][INFO    ][27929] Completed state [/etc/apt/preferences.d/uca] at time 07:34:57.836001 duration_in_ms=1.452
2018-01-25 07:34:57,837 [salt.state       ][INFO    ][27929] Running state [deb http://ubuntu-cloud.archive.canonical.com/ubuntu xenial-updates/pike main] at time 07:34:57.837422
2018-01-25 07:34:57,838 [salt.state       ][INFO    ][27929] Executing state pkgrepo.managed for deb http://ubuntu-cloud.archive.canonical.com/ubuntu xenial-updates/pike main
2018-01-25 07:34:57,991 [salt.loaded.int.module.cmdmod][INFO    ][27929] Executing command ['apt-key', 'export', 'EC4926EA'] in directory '/root'
2018-01-25 07:34:58,095 [salt.loaded.int.module.cmdmod][INFO    ][27929] Executing command ['apt-key', 'adv', '--keyserver', 'keyserver.ubuntu.com', '--logger-fd', '1', '--recv-keys', 'EC4926EA'] in directory '/root'
2018-01-25 07:34:58,433 [salt.loaded.int.module.cmdmod][INFO    ][27929] Executing command ['apt-get', '-q', 'update'] in directory '/root'
2018-01-25 07:35:02,689 [salt.state       ][INFO    ][27929] {'repo': 'deb http://ubuntu-cloud.archive.canonical.com/ubuntu xenial-updates/pike main'}
2018-01-25 07:35:02,691 [salt.state       ][INFO    ][27929] Completed state [deb http://ubuntu-cloud.archive.canonical.com/ubuntu xenial-updates/pike main] at time 07:35:02.691687 duration_in_ms=4854.264
2018-01-25 07:35:02,692 [salt.state       ][INFO    ][27929] Running state [/etc/apt/apt.conf.d/99proxies-salt-mcp_salt] at time 07:35:02.692568
2018-01-25 07:35:02,693 [salt.state       ][INFO    ][27929] Executing state file.absent for /etc/apt/apt.conf.d/99proxies-salt-mcp_salt
2018-01-25 07:35:02,694 [salt.state       ][INFO    ][27929] File /etc/apt/apt.conf.d/99proxies-salt-mcp_salt is not present
2018-01-25 07:35:02,694 [salt.state       ][INFO    ][27929] Completed state [/etc/apt/apt.conf.d/99proxies-salt-mcp_salt] at time 07:35:02.694586 duration_in_ms=2.018
2018-01-25 07:35:02,695 [salt.state       ][INFO    ][27929] Running state [/etc/apt/preferences.d/mcp_salt] at time 07:35:02.695087
2018-01-25 07:35:02,695 [salt.state       ][INFO    ][27929] Executing state file.managed for /etc/apt/preferences.d/mcp_salt
2018-01-25 07:35:02,732 [salt.fileclient  ][INFO    ][27929] Fetching file from saltenv 'base', ** done ** 'linux/files/preferences_repo'
2018-01-25 07:35:02,821 [salt.state       ][INFO    ][27929] File changed:
New file
2018-01-25 07:35:02,822 [salt.state       ][INFO    ][27929] Completed state [/etc/apt/preferences.d/mcp_salt] at time 07:35:02.822481 duration_in_ms=127.393
2018-01-25 07:35:02,824 [salt.state       ][INFO    ][27929] Running state [deb [arch=amd64] http://apt.mirantis.com/xenial/ stable salt] at time 07:35:02.824136
2018-01-25 07:35:02,824 [salt.state       ][INFO    ][27929] Executing state pkgrepo.managed for deb [arch=amd64] http://apt.mirantis.com/xenial/ stable salt
2018-01-25 07:35:03,453 [salt.loaded.int.module.cmdmod][INFO    ][27929] Executing command ['apt-key', 'add', '/var/cache/salt/minion/extrn_files/base/apt.mirantis.com/public.gpg'] in directory '/root'
2018-01-25 07:35:03,606 [salt.loaded.int.module.cmdmod][INFO    ][27929] Executing command ['apt-get', '-q', 'update'] in directory '/root'
2018-01-25 07:35:06,062 [salt.minion      ][INFO    ][27383] User sudo_ubuntu Executing command saltutil.find_job with jid 20180125073506044803
2018-01-25 07:35:07,141 [salt.minion      ][INFO    ][29410] Starting a new job with PID 29410
2018-01-25 07:35:07,164 [salt.minion      ][INFO    ][29410] Returning information for job: 20180125073506044803
2018-01-25 07:35:08,332 [salt.state       ][INFO    ][27929] {'repo': 'deb [arch=amd64] http://apt.mirantis.com/xenial stable salt'}
2018-01-25 07:35:08,333 [salt.state       ][INFO    ][27929] Completed state [deb [arch=amd64] http://apt.mirantis.com/xenial/ stable salt] at time 07:35:08.333663 duration_in_ms=5509.526
2018-01-25 07:35:08,334 [salt.state       ][INFO    ][27929] Running state [linux_extra_packages_purged] at time 07:35:08.334617
2018-01-25 07:35:08,335 [salt.state       ][INFO    ][27929] Executing state pkg.purged for linux_extra_packages_purged
2018-01-25 07:35:08,374 [salt.loaded.int.module.cmdmod][INFO    ][27929] Executing command ['systemd-run', '--scope', 'apt-get', '-q', '-y', 'purge', 'cloud-init', 'unattended-upgrades'] in directory '/root'
2018-01-25 07:35:13,163 [salt.loaded.int.module.cmdmod][INFO    ][27929] Executing command ['dpkg-query', '--showformat', '${Status} ${Package} ${Version} ${Architecture}\n', '-W'] in directory '/root'
2018-01-25 07:35:13,209 [salt.state       ][INFO    ][27929] {'removed': {}, 'installed': {'cloud-init': {'new': '', 'old': '17.1-46-g7acc9e68-0ubuntu1~16.04.1'}, 'ec2-init': {'new': '', 'old': '1'}, 'unattended-upgrades': {'new': '', 'old': '0.90ubuntu0.9'}}}
2018-01-25 07:35:13,233 [salt.state       ][INFO    ][27929] Loading fresh modules for state activity
2018-01-25 07:35:13,268 [salt.state       ][INFO    ][27929] Completed state [linux_extra_packages_purged] at time 07:35:13.267956 duration_in_ms=4933.338
2018-01-25 07:35:13,272 [salt.state       ][INFO    ][27929] Running state [linux_extra_packages_latest] at time 07:35:13.272930
2018-01-25 07:35:13,273 [salt.state       ][INFO    ][27929] Executing state pkg.latest for linux_extra_packages_latest
2018-01-25 07:35:13,756 [salt.loaded.int.module.cmdmod][INFO    ][27929] Executing command ['apt-cache', '-q', 'policy', 'mcelog'] in directory '/root'
2018-01-25 07:35:13,820 [salt.loaded.int.module.cmdmod][INFO    ][27929] Executing command ['dpkg', '--get-selections', '*'] in directory '/root'
2018-01-25 07:35:13,859 [salt.loaded.int.module.cmdmod][INFO    ][27929] Executing command ['systemd-run', '--scope', 'apt-get', '-q', '-y', '-o', 'DPkg::Options::=--force-confold', '-o', 'DPkg::Options::=--force-confdef', 'install', 'mcelog'] in directory '/root'
2018-01-25 07:35:16,287 [salt.minion      ][INFO    ][27383] User sudo_ubuntu Executing command saltutil.find_job with jid 20180125073516274355
2018-01-25 07:35:16,307 [salt.minion      ][INFO    ][30565] Starting a new job with PID 30565
2018-01-25 07:35:16,329 [salt.minion      ][INFO    ][30565] Returning information for job: 20180125073516274355
2018-01-25 07:35:16,846 [salt.loaded.int.module.cmdmod][INFO    ][27929] Executing command ['dpkg-query', '--showformat', '${Status} ${Package} ${Version} ${Architecture}\n', '-W'] in directory '/root'
2018-01-25 07:35:16,888 [salt.state       ][INFO    ][27929] Made the following changes:
'mcelog' changed from 'absent' to '128+dfsg-1'

2018-01-25 07:35:16,907 [salt.state       ][INFO    ][27929] Loading fresh modules for state activity
2018-01-25 07:35:16,938 [salt.state       ][INFO    ][27929] Completed state [linux_extra_packages_latest] at time 07:35:16.938199 duration_in_ms=3665.267
2018-01-25 07:35:16,941 [salt.state       ][INFO    ][27929] Running state [UTC] at time 07:35:16.941714
2018-01-25 07:35:16,942 [salt.state       ][INFO    ][27929] Executing state timezone.system for UTC
2018-01-25 07:35:16,944 [salt.loaded.int.module.cmdmod][INFO    ][27929] Executing command ['timedatectl'] in directory '/root'
2018-01-25 07:35:17,049 [salt.loaded.int.module.cmdmod][INFO    ][27929] Executing command ['timedatectl'] in directory '/root'
2018-01-25 07:35:17,065 [salt.loaded.int.module.cmdmod][INFO    ][27929] Executing command 'timedatectl set-timezone UTC' in directory '/root'
2018-01-25 07:35:17,080 [salt.state       ][INFO    ][27929] {'timezone': 'UTC'}
2018-01-25 07:35:17,081 [salt.state       ][INFO    ][27929] Completed state [UTC] at time 07:35:17.081133 duration_in_ms=139.419
2018-01-25 07:35:17,084 [salt.state       ][INFO    ][27929] Running state [nf_conntrack] at time 07:35:17.084207
2018-01-25 07:35:17,084 [salt.state       ][INFO    ][27929] Executing state kmod.present for nf_conntrack
2018-01-25 07:35:17,085 [salt.loaded.int.module.cmdmod][INFO    ][27929] Executing command 'lsmod' in directory '/root'
2018-01-25 07:35:17,228 [salt.loaded.int.module.cmdmod][INFO    ][27929] Executing command 'lsmod' in directory '/root'
2018-01-25 07:35:17,244 [salt.loaded.int.module.cmdmod][INFO    ][27929] Executing command 'modprobe nf_conntrack' in directory '/root'
2018-01-25 07:35:17,324 [salt.loaded.int.module.cmdmod][INFO    ][27929] Executing command 'lsmod' in directory '/root'
2018-01-25 07:35:17,370 [salt.state       ][INFO    ][27929] {'nf_conntrack': 'loaded'}
2018-01-25 07:35:17,370 [salt.state       ][INFO    ][27929] Completed state [nf_conntrack] at time 07:35:17.370847 duration_in_ms=286.639
2018-01-25 07:35:17,374 [salt.state       ][INFO    ][27929] Running state [kernel.panic] at time 07:35:17.374692
2018-01-25 07:35:17,375 [salt.state       ][INFO    ][27929] Executing state sysctl.present for kernel.panic
2018-01-25 07:35:17,375 [salt.loaded.int.module.cmdmod][INFO    ][27929] Executing command 'sysctl -a' in directory '/root'
2018-01-25 07:35:17,464 [salt.loaded.int.module.cmdmod][INFO    ][27929] Executing command 'sysctl -w kernel.panic="60"' in directory '/root'
2018-01-25 07:35:17,476 [salt.state       ][INFO    ][27929] {'kernel.panic': 60}
2018-01-25 07:35:17,477 [salt.state       ][INFO    ][27929] Completed state [kernel.panic] at time 07:35:17.476930 duration_in_ms=102.238
2018-01-25 07:35:17,477 [salt.state       ][INFO    ][27929] Running state [net.ipv4.tcp_keepalive_probes] at time 07:35:17.477346
2018-01-25 07:35:17,477 [salt.state       ][INFO    ][27929] Executing state sysctl.present for net.ipv4.tcp_keepalive_probes
2018-01-25 07:35:17,478 [salt.loaded.int.module.cmdmod][INFO    ][27929] Executing command 'sysctl -a' in directory '/root'
2018-01-25 07:35:17,507 [salt.loaded.int.module.cmdmod][INFO    ][27929] Executing command 'sysctl -w net.ipv4.tcp_keepalive_probes="8"' in directory '/root'
2018-01-25 07:35:17,517 [salt.state       ][INFO    ][27929] {'net.ipv4.tcp_keepalive_probes': 8}
2018-01-25 07:35:17,517 [salt.state       ][INFO    ][27929] Completed state [net.ipv4.tcp_keepalive_probes] at time 07:35:17.517748 duration_in_ms=40.402
2018-01-25 07:35:17,518 [salt.state       ][INFO    ][27929] Running state [fs.file-max] at time 07:35:17.518436
2018-01-25 07:35:17,518 [salt.state       ][INFO    ][27929] Executing state sysctl.present for fs.file-max
2018-01-25 07:35:17,519 [salt.loaded.int.module.cmdmod][INFO    ][27929] Executing command 'sysctl -a' in directory '/root'
2018-01-25 07:35:17,544 [salt.loaded.int.module.cmdmod][INFO    ][27929] Executing command 'sysctl -w fs.file-max="124165"' in directory '/root'
2018-01-25 07:35:17,554 [salt.state       ][INFO    ][27929] {'fs.file-max': 124165}
2018-01-25 07:35:17,554 [salt.state       ][INFO    ][27929] Completed state [fs.file-max] at time 07:35:17.554898 duration_in_ms=36.462
2018-01-25 07:35:17,555 [salt.state       ][INFO    ][27929] Running state [net.core.somaxconn] at time 07:35:17.555264
2018-01-25 07:35:17,555 [salt.state       ][INFO    ][27929] Executing state sysctl.present for net.core.somaxconn
2018-01-25 07:35:17,556 [salt.loaded.int.module.cmdmod][INFO    ][27929] Executing command 'sysctl -a' in directory '/root'
2018-01-25 07:35:17,582 [salt.loaded.int.module.cmdmod][INFO    ][27929] Executing command 'sysctl -w net.core.somaxconn="4096"' in directory '/root'
2018-01-25 07:35:17,595 [salt.state       ][INFO    ][27929] {'net.core.somaxconn': 4096}
2018-01-25 07:35:17,596 [salt.state       ][INFO    ][27929] Completed state [net.core.somaxconn] at time 07:35:17.596041 duration_in_ms=40.775
2018-01-25 07:35:17,596 [salt.state       ][INFO    ][27929] Running state [net.ipv4.tcp_max_syn_backlog] at time 07:35:17.596780
2018-01-25 07:35:17,597 [salt.state       ][INFO    ][27929] Executing state sysctl.present for net.ipv4.tcp_max_syn_backlog
2018-01-25 07:35:17,598 [salt.loaded.int.module.cmdmod][INFO    ][27929] Executing command 'sysctl -a' in directory '/root'
2018-01-25 07:35:17,629 [salt.loaded.int.module.cmdmod][INFO    ][27929] Executing command 'sysctl -w net.ipv4.tcp_max_syn_backlog="8192"' in directory '/root'
2018-01-25 07:35:17,643 [salt.state       ][INFO    ][27929] {'net.ipv4.tcp_max_syn_backlog': 8192}
2018-01-25 07:35:17,644 [salt.state       ][INFO    ][27929] Completed state [net.ipv4.tcp_max_syn_backlog] at time 07:35:17.644024 duration_in_ms=47.244
2018-01-25 07:35:17,644 [salt.state       ][INFO    ][27929] Running state [net.ipv4.tcp_tw_reuse] at time 07:35:17.644652
2018-01-25 07:35:17,645 [salt.state       ][INFO    ][27929] Executing state sysctl.present for net.ipv4.tcp_tw_reuse
2018-01-25 07:35:17,646 [salt.loaded.int.module.cmdmod][INFO    ][27929] Executing command 'sysctl -a' in directory '/root'
2018-01-25 07:35:17,682 [salt.loaded.int.module.cmdmod][INFO    ][27929] Executing command 'sysctl -w net.ipv4.tcp_tw_reuse="1"' in directory '/root'
2018-01-25 07:35:17,695 [salt.state       ][INFO    ][27929] {'net.ipv4.tcp_tw_reuse': 1}
2018-01-25 07:35:17,696 [salt.state       ][INFO    ][27929] Completed state [net.ipv4.tcp_tw_reuse] at time 07:35:17.696293 duration_in_ms=51.641
2018-01-25 07:35:17,696 [salt.state       ][INFO    ][27929] Running state [net.ipv4.tcp_congestion_control] at time 07:35:17.696784
2018-01-25 07:35:17,697 [salt.state       ][INFO    ][27929] Executing state sysctl.present for net.ipv4.tcp_congestion_control
2018-01-25 07:35:17,698 [salt.loaded.int.module.cmdmod][INFO    ][27929] Executing command 'sysctl -a' in directory '/root'
2018-01-25 07:35:17,730 [salt.loaded.int.module.cmdmod][INFO    ][27929] Executing command 'sysctl -w net.ipv4.tcp_congestion_control="yeah"' in directory '/root'
2018-01-25 07:35:17,753 [salt.state       ][INFO    ][27929] {'net.ipv4.tcp_congestion_control': 'yeah'}
2018-01-25 07:35:17,753 [salt.state       ][INFO    ][27929] Completed state [net.ipv4.tcp_congestion_control] at time 07:35:17.753385 duration_in_ms=56.601
2018-01-25 07:35:17,753 [salt.state       ][INFO    ][27929] Running state [net.ipv4.tcp_retries2] at time 07:35:17.753765
2018-01-25 07:35:17,754 [salt.state       ][INFO    ][27929] Executing state sysctl.present for net.ipv4.tcp_retries2
2018-01-25 07:35:17,755 [salt.loaded.int.module.cmdmod][INFO    ][27929] Executing command 'sysctl -a' in directory '/root'
2018-01-25 07:35:17,783 [salt.loaded.int.module.cmdmod][INFO    ][27929] Executing command 'sysctl -w net.ipv4.tcp_retries2="5"' in directory '/root'
2018-01-25 07:35:17,793 [salt.state       ][INFO    ][27929] {'net.ipv4.tcp_retries2': 5}
2018-01-25 07:35:17,793 [salt.state       ][INFO    ][27929] Completed state [net.ipv4.tcp_retries2] at time 07:35:17.793366 duration_in_ms=39.6
2018-01-25 07:35:17,793 [salt.state       ][INFO    ][27929] Running state [net.ipv4.tcp_keepalive_intvl] at time 07:35:17.793731
2018-01-25 07:35:17,794 [salt.state       ][INFO    ][27929] Executing state sysctl.present for net.ipv4.tcp_keepalive_intvl
2018-01-25 07:35:17,795 [salt.loaded.int.module.cmdmod][INFO    ][27929] Executing command 'sysctl -a' in directory '/root'
2018-01-25 07:35:17,826 [salt.loaded.int.module.cmdmod][INFO    ][27929] Executing command 'sysctl -w net.ipv4.tcp_keepalive_intvl="3"' in directory '/root'
2018-01-25 07:35:17,838 [salt.state       ][INFO    ][27929] {'net.ipv4.tcp_keepalive_intvl': 3}
2018-01-25 07:35:17,839 [salt.state       ][INFO    ][27929] Completed state [net.ipv4.tcp_keepalive_intvl] at time 07:35:17.839159 duration_in_ms=45.427
2018-01-25 07:35:17,839 [salt.state       ][INFO    ][27929] Running state [net.ipv4.tcp_slow_start_after_idle] at time 07:35:17.839666
2018-01-25 07:35:17,840 [salt.state       ][INFO    ][27929] Executing state sysctl.present for net.ipv4.tcp_slow_start_after_idle
2018-01-25 07:35:17,840 [salt.loaded.int.module.cmdmod][INFO    ][27929] Executing command 'sysctl -a' in directory '/root'
2018-01-25 07:35:17,874 [salt.loaded.int.module.cmdmod][INFO    ][27929] Executing command 'sysctl -w net.ipv4.tcp_slow_start_after_idle="0"' in directory '/root'
2018-01-25 07:35:17,887 [salt.state       ][INFO    ][27929] {'net.ipv4.tcp_slow_start_after_idle': 0}
2018-01-25 07:35:17,887 [salt.state       ][INFO    ][27929] Completed state [net.ipv4.tcp_slow_start_after_idle] at time 07:35:17.887510 duration_in_ms=47.844
2018-01-25 07:35:17,887 [salt.state       ][INFO    ][27929] Running state [vm.swappiness] at time 07:35:17.887941
2018-01-25 07:35:17,888 [salt.state       ][INFO    ][27929] Executing state sysctl.present for vm.swappiness
2018-01-25 07:35:17,889 [salt.loaded.int.module.cmdmod][INFO    ][27929] Executing command 'sysctl -a' in directory '/root'
2018-01-25 07:35:17,922 [salt.loaded.int.module.cmdmod][INFO    ][27929] Executing command 'sysctl -w vm.swappiness="10"' in directory '/root'
2018-01-25 07:35:17,935 [salt.state       ][INFO    ][27929] {'vm.swappiness': 10}
2018-01-25 07:35:17,936 [salt.state       ][INFO    ][27929] Completed state [vm.swappiness] at time 07:35:17.936591 duration_in_ms=48.65
2018-01-25 07:35:17,937 [salt.state       ][INFO    ][27929] Running state [net.core.netdev_max_backlog] at time 07:35:17.936985
2018-01-25 07:35:17,937 [salt.state       ][INFO    ][27929] Executing state sysctl.present for net.core.netdev_max_backlog
2018-01-25 07:35:17,938 [salt.loaded.int.module.cmdmod][INFO    ][27929] Executing command 'sysctl -a' in directory '/root'
2018-01-25 07:35:17,968 [salt.loaded.int.module.cmdmod][INFO    ][27929] Executing command 'sysctl -w net.core.netdev_max_backlog="261144"' in directory '/root'
2018-01-25 07:35:17,981 [salt.state       ][INFO    ][27929] {'net.core.netdev_max_backlog': 261144}
2018-01-25 07:35:17,981 [salt.state       ][INFO    ][27929] Completed state [net.core.netdev_max_backlog] at time 07:35:17.981527 duration_in_ms=44.542
2018-01-25 07:35:17,982 [salt.state       ][INFO    ][27929] Running state [net.ipv4.neigh.default.gc_thresh1] at time 07:35:17.981879
2018-01-25 07:35:17,982 [salt.state       ][INFO    ][27929] Executing state sysctl.present for net.ipv4.neigh.default.gc_thresh1
2018-01-25 07:35:17,983 [salt.loaded.int.module.cmdmod][INFO    ][27929] Executing command 'sysctl -a' in directory '/root'
2018-01-25 07:35:18,014 [salt.loaded.int.module.cmdmod][INFO    ][27929] Executing command 'sysctl -w net.ipv4.neigh.default.gc_thresh1="4096"' in directory '/root'
2018-01-25 07:35:18,028 [salt.state       ][INFO    ][27929] {'net.ipv4.neigh.default.gc_thresh1': 4096}
2018-01-25 07:35:18,028 [salt.state       ][INFO    ][27929] Completed state [net.ipv4.neigh.default.gc_thresh1] at time 07:35:18.028869 duration_in_ms=46.99
2018-01-25 07:35:18,029 [salt.state       ][INFO    ][27929] Running state [net.ipv4.neigh.default.gc_thresh2] at time 07:35:18.029237
2018-01-25 07:35:18,029 [salt.state       ][INFO    ][27929] Executing state sysctl.present for net.ipv4.neigh.default.gc_thresh2
2018-01-25 07:35:18,030 [salt.loaded.int.module.cmdmod][INFO    ][27929] Executing command 'sysctl -a' in directory '/root'
2018-01-25 07:35:18,067 [salt.loaded.int.module.cmdmod][INFO    ][27929] Executing command 'sysctl -w net.ipv4.neigh.default.gc_thresh2="8192"' in directory '/root'
2018-01-25 07:35:18,082 [salt.state       ][INFO    ][27929] {'net.ipv4.neigh.default.gc_thresh2': 8192}
2018-01-25 07:35:18,082 [salt.state       ][INFO    ][27929] Completed state [net.ipv4.neigh.default.gc_thresh2] at time 07:35:18.082809 duration_in_ms=53.571
2018-01-25 07:35:18,083 [salt.state       ][INFO    ][27929] Running state [net.ipv4.neigh.default.gc_thresh3] at time 07:35:18.083677
2018-01-25 07:35:18,084 [salt.state       ][INFO    ][27929] Executing state sysctl.present for net.ipv4.neigh.default.gc_thresh3
2018-01-25 07:35:18,085 [salt.loaded.int.module.cmdmod][INFO    ][27929] Executing command 'sysctl -a' in directory '/root'
2018-01-25 07:35:18,121 [salt.loaded.int.module.cmdmod][INFO    ][27929] Executing command 'sysctl -w net.ipv4.neigh.default.gc_thresh3="16384"' in directory '/root'
2018-01-25 07:35:18,134 [salt.state       ][INFO    ][27929] {'net.ipv4.neigh.default.gc_thresh3': 16384}
2018-01-25 07:35:18,135 [salt.state       ][INFO    ][27929] Completed state [net.ipv4.neigh.default.gc_thresh3] at time 07:35:18.135079 duration_in_ms=51.402
2018-01-25 07:35:18,136 [salt.state       ][INFO    ][27929] Running state [net.ipv4.tcp_fin_timeout] at time 07:35:18.135956
2018-01-25 07:35:18,136 [salt.state       ][INFO    ][27929] Executing state sysctl.present for net.ipv4.tcp_fin_timeout
2018-01-25 07:35:18,138 [salt.loaded.int.module.cmdmod][INFO    ][27929] Executing command 'sysctl -a' in directory '/root'
2018-01-25 07:35:18,172 [salt.loaded.int.module.cmdmod][INFO    ][27929] Executing command 'sysctl -w net.ipv4.tcp_fin_timeout="30"' in directory '/root'
2018-01-25 07:35:18,186 [salt.state       ][INFO    ][27929] {'net.ipv4.tcp_fin_timeout': 30}
2018-01-25 07:35:18,187 [salt.state       ][INFO    ][27929] Completed state [net.ipv4.tcp_fin_timeout] at time 07:35:18.187538 duration_in_ms=51.583
2018-01-25 07:35:18,188 [salt.state       ][INFO    ][27929] Running state [net.ipv4.tcp_keepalive_time] at time 07:35:18.188302
2018-01-25 07:35:18,189 [salt.state       ][INFO    ][27929] Executing state sysctl.present for net.ipv4.tcp_keepalive_time
2018-01-25 07:35:18,190 [salt.loaded.int.module.cmdmod][INFO    ][27929] Executing command 'sysctl -a' in directory '/root'
2018-01-25 07:35:18,223 [salt.loaded.int.module.cmdmod][INFO    ][27929] Executing command 'sysctl -w net.ipv4.tcp_keepalive_time="30"' in directory '/root'
2018-01-25 07:35:18,236 [salt.state       ][INFO    ][27929] {'net.ipv4.tcp_keepalive_time': 30}
2018-01-25 07:35:18,237 [salt.state       ][INFO    ][27929] Completed state [net.ipv4.tcp_keepalive_time] at time 07:35:18.237473 duration_in_ms=49.171
2018-01-25 07:35:18,238 [salt.state       ][INFO    ][27929] Running state [net.nf_conntrack_max] at time 07:35:18.238116
2018-01-25 07:35:18,238 [salt.state       ][INFO    ][27929] Executing state sysctl.present for net.nf_conntrack_max
2018-01-25 07:35:18,239 [salt.loaded.int.module.cmdmod][INFO    ][27929] Executing command 'sysctl -a' in directory '/root'
2018-01-25 07:35:18,270 [salt.loaded.int.module.cmdmod][INFO    ][27929] Executing command 'sysctl -w net.nf_conntrack_max="1048576"' in directory '/root'
2018-01-25 07:35:18,283 [salt.state       ][INFO    ][27929] {'net.nf_conntrack_max': 1048576}
2018-01-25 07:35:18,284 [salt.state       ][INFO    ][27929] Completed state [net.nf_conntrack_max] at time 07:35:18.284484 duration_in_ms=46.367
2018-01-25 07:35:18,290 [salt.state       ][INFO    ][27929] Running state [linux_sysfs_package] at time 07:35:18.290728
2018-01-25 07:35:18,291 [salt.state       ][INFO    ][27929] Executing state pkg.installed for linux_sysfs_package
2018-01-25 07:35:18,719 [salt.loaded.int.module.cmdmod][INFO    ][27929] Executing command ['apt-cache', '-q', 'policy', 'sysfsutils'] in directory '/root'
2018-01-25 07:35:18,797 [salt.loaded.int.module.cmdmod][INFO    ][27929] Executing command ['apt-get', '-q', 'update'] in directory '/root'
2018-01-25 07:35:21,140 [salt.loaded.int.module.cmdmod][INFO    ][27929] Executing command ['dpkg', '--get-selections', '*'] in directory '/root'
2018-01-25 07:35:21,175 [salt.loaded.int.module.cmdmod][INFO    ][27929] Executing command ['systemd-run', '--scope', 'apt-get', '-q', '-y', '-o', 'DPkg::Options::=--force-confold', '-o', 'DPkg::Options::=--force-confdef', 'install', 'sysfsutils'] in directory '/root'
2018-01-25 07:35:24,247 [salt.loaded.int.module.cmdmod][INFO    ][27929] Executing command ['dpkg-query', '--showformat', '${Status} ${Package} ${Version} ${Architecture}\n', '-W'] in directory '/root'
2018-01-25 07:35:24,295 [salt.state       ][INFO    ][27929] Made the following changes:
'libsysfs2' changed from 'absent' to '2.1.0+repack-4'
'sysfsutils' changed from 'absent' to '2.1.0+repack-4'

2018-01-25 07:35:24,313 [salt.state       ][INFO    ][27929] Loading fresh modules for state activity
2018-01-25 07:35:24,344 [salt.state       ][INFO    ][27929] Completed state [linux_sysfs_package] at time 07:35:24.344091 duration_in_ms=6053.362
2018-01-25 07:35:24,348 [salt.state       ][INFO    ][27929] Running state [/etc/sysfs.d] at time 07:35:24.348375
2018-01-25 07:35:24,348 [salt.state       ][INFO    ][27929] Executing state file.directory for /etc/sysfs.d
2018-01-25 07:35:24,354 [salt.state       ][INFO    ][27929] Directory /etc/sysfs.d is in the correct state
2018-01-25 07:35:24,354 [salt.state       ][INFO    ][27929] Completed state [/etc/sysfs.d] at time 07:35:24.354777 duration_in_ms=6.401
2018-01-25 07:35:24,407 [salt.state       ][INFO    ][27929] Running state [ondemand] at time 07:35:24.407319
2018-01-25 07:35:24,407 [salt.state       ][INFO    ][27929] Executing state service.dead for ondemand
2018-01-25 07:35:24,411 [salt.loaded.int.module.cmdmod][INFO    ][27929] Executing command ['systemctl', 'status', 'ondemand.service', '-n', '0'] in directory '/root'
2018-01-25 07:35:24,432 [salt.loaded.int.module.cmdmod][INFO    ][27929] Executing command ['systemctl', 'is-active', 'ondemand.service'] in directory '/root'
2018-01-25 07:35:24,449 [salt.loaded.int.module.cmdmod][INFO    ][27929] Executing command ['systemctl', 'is-enabled', 'ondemand.service'] in directory '/root'
2018-01-25 07:35:24,467 [salt.loaded.int.module.cmdmod][INFO    ][27929] Executing command ['systemd-run', '--scope', 'systemctl', 'stop', 'ondemand.service'] in directory '/root'
2018-01-25 07:35:24,547 [salt.loaded.int.module.cmdmod][INFO    ][27929] Executing command ['systemctl', 'is-active', 'ondemand.service'] in directory '/root'
2018-01-25 07:35:24,562 [salt.loaded.int.module.cmdmod][INFO    ][27929] Executing command ['systemctl', 'is-enabled', 'ondemand.service'] in directory '/root'
2018-01-25 07:35:24,581 [salt.loaded.int.module.cmdmod][INFO    ][27929] Executing command ['systemctl', 'is-enabled', 'ondemand.service'] in directory '/root'
2018-01-25 07:35:24,604 [salt.loaded.int.module.cmdmod][INFO    ][27929] Executing command ['systemd-run', '--scope', '/usr/sbin/update-rc.d', '-f', 'ondemand', 'remove'] in directory '/root'
2018-01-25 07:35:24,757 [salt.loaded.int.module.cmdmod][INFO    ][27929] Executing command ['systemctl', 'is-enabled', 'ondemand.service'] in directory '/root'
2018-01-25 07:35:24,779 [salt.loaded.int.module.cmdmod][INFO    ][27929] Executing command 'runlevel' in directory '/root'
2018-01-25 07:35:24,792 [salt.state       ][INFO    ][27929] {'ondemand': True}
2018-01-25 07:35:24,792 [salt.state       ][INFO    ][27929] Completed state [ondemand] at time 07:35:24.792521 duration_in_ms=385.202
2018-01-25 07:35:24,796 [salt.state       ][INFO    ][27929] Running state [cs_CZ.UTF-8] at time 07:35:24.796916
2018-01-25 07:35:24,797 [salt.state       ][INFO    ][27929] Executing state locale.present for cs_CZ.UTF-8
2018-01-25 07:35:24,798 [salt.loaded.int.module.cmdmod][INFO    ][27929] Executing command 'locale -a' in directory '/root'
2018-01-25 07:35:24,815 [salt.loaded.int.module.cmdmod][INFO    ][27929] Executing command ['locale-gen', 'cs_CZ.utf8'] in directory '/root'
2018-01-25 07:35:25,643 [salt.state       ][INFO    ][27929] {'locale': 'cs_CZ.UTF-8'}
2018-01-25 07:35:25,644 [salt.state       ][INFO    ][27929] Completed state [cs_CZ.UTF-8] at time 07:35:25.644569 duration_in_ms=847.652
2018-01-25 07:35:25,645 [salt.state       ][INFO    ][27929] Running state [en_US.UTF-8] at time 07:35:25.644975
2018-01-25 07:35:25,645 [salt.state       ][INFO    ][27929] Executing state locale.present for en_US.UTF-8
2018-01-25 07:35:25,646 [salt.loaded.int.module.cmdmod][INFO    ][27929] Executing command 'locale -a' in directory '/root'
2018-01-25 07:35:25,663 [salt.state       ][INFO    ][27929] Locale en_US.UTF-8 is already present
2018-01-25 07:35:25,663 [salt.state       ][INFO    ][27929] Completed state [en_US.UTF-8] at time 07:35:25.663574 duration_in_ms=18.599
2018-01-25 07:35:25,665 [salt.state       ][INFO    ][27929] Running state [en_US.UTF-8] at time 07:35:25.665904
2018-01-25 07:35:25,666 [salt.state       ][INFO    ][27929] Executing state locale.system for en_US.UTF-8
2018-01-25 07:35:25,667 [salt.loaded.int.module.cmdmod][INFO    ][27929] Executing command 'localectl' in directory '/root'
2018-01-25 07:35:25,776 [salt.state       ][INFO    ][27929] System locale en_US.UTF-8 already set
2018-01-25 07:35:25,777 [salt.state       ][INFO    ][27929] Completed state [en_US.UTF-8] at time 07:35:25.777493 duration_in_ms=111.588
2018-01-25 07:35:25,780 [salt.state       ][INFO    ][27929] Running state [root] at time 07:35:25.780718
2018-01-25 07:35:25,781 [salt.state       ][INFO    ][27929] Executing state user.present for root
2018-01-25 07:35:25,788 [salt.state       ][INFO    ][27929] User root is present and up to date
2018-01-25 07:35:25,789 [salt.state       ][INFO    ][27929] Completed state [root] at time 07:35:25.789423 duration_in_ms=8.705
2018-01-25 07:35:25,791 [salt.state       ][INFO    ][27929] Running state [/root] at time 07:35:25.791253
2018-01-25 07:35:25,791 [salt.state       ][INFO    ][27929] Executing state file.directory for /root
2018-01-25 07:35:25,792 [salt.state       ][INFO    ][27929] Directory /root is in the correct state
2018-01-25 07:35:25,793 [salt.state       ][INFO    ][27929] Completed state [/root] at time 07:35:25.793313 duration_in_ms=2.06
2018-01-25 07:35:25,793 [salt.state       ][INFO    ][27929] Running state [/etc/sudoers.d/90-salt-user-root] at time 07:35:25.793820
2018-01-25 07:35:25,794 [salt.state       ][INFO    ][27929] Executing state file.absent for /etc/sudoers.d/90-salt-user-root
2018-01-25 07:35:25,795 [salt.state       ][INFO    ][27929] File /etc/sudoers.d/90-salt-user-root is not present
2018-01-25 07:35:25,795 [salt.state       ][INFO    ][27929] Completed state [/etc/sudoers.d/90-salt-user-root] at time 07:35:25.795891 duration_in_ms=2.07
2018-01-25 07:35:25,796 [salt.state       ][INFO    ][27929] Running state [salt] at time 07:35:25.796381
2018-01-25 07:35:25,796 [salt.state       ][INFO    ][27929] Executing state user.present for salt
2018-01-25 07:35:25,798 [salt.state       ][INFO    ][27929] User salt is present and up to date
2018-01-25 07:35:25,798 [salt.state       ][INFO    ][27929] Completed state [salt] at time 07:35:25.798603 duration_in_ms=2.222
2018-01-25 07:35:25,799 [salt.state       ][INFO    ][27929] Running state [/var/tmp/salt] at time 07:35:25.799932
2018-01-25 07:35:25,800 [salt.state       ][INFO    ][27929] Executing state file.directory for /var/tmp/salt
2018-01-25 07:35:25,801 [salt.state       ][INFO    ][27929] Directory /var/tmp/salt is in the correct state
2018-01-25 07:35:25,801 [salt.state       ][INFO    ][27929] Completed state [/var/tmp/salt] at time 07:35:25.801912 duration_in_ms=1.98
2018-01-25 07:35:25,802 [salt.state       ][INFO    ][27929] Running state [/etc/sudoers.d/90-salt-user-salt] at time 07:35:25.802707
2018-01-25 07:35:25,803 [salt.state       ][INFO    ][27929] Executing state file.absent for /etc/sudoers.d/90-salt-user-salt
2018-01-25 07:35:25,803 [salt.state       ][INFO    ][27929] File /etc/sudoers.d/90-salt-user-salt is not present
2018-01-25 07:35:25,804 [salt.state       ][INFO    ][27929] Completed state [/etc/sudoers.d/90-salt-user-salt] at time 07:35:25.804190 duration_in_ms=1.483
2018-01-25 07:35:25,804 [salt.state       ][INFO    ][27929] Running state [ubuntu] at time 07:35:25.804689
2018-01-25 07:35:25,805 [salt.state       ][INFO    ][27929] Executing state user.present for ubuntu
2018-01-25 07:35:25,806 [salt.state       ][INFO    ][27929] User ubuntu is present and up to date
2018-01-25 07:35:25,807 [salt.state       ][INFO    ][27929] Completed state [ubuntu] at time 07:35:25.806982 duration_in_ms=2.293
2018-01-25 07:35:25,808 [salt.state       ][INFO    ][27929] Running state [/home/ubuntu] at time 07:35:25.808320
2018-01-25 07:35:25,808 [salt.state       ][INFO    ][27929] Executing state file.directory for /home/ubuntu
2018-01-25 07:35:25,809 [salt.state       ][INFO    ][27929] Directory /home/ubuntu is in the correct state
2018-01-25 07:35:25,810 [salt.state       ][INFO    ][27929] Completed state [/home/ubuntu] at time 07:35:25.810282 duration_in_ms=1.962
2018-01-25 07:35:25,811 [salt.state       ][INFO    ][27929] Running state [/etc/sudoers.d/90-salt-user-ubuntu] at time 07:35:25.811765
2018-01-25 07:35:25,812 [salt.state       ][INFO    ][27929] Executing state file.managed for /etc/sudoers.d/90-salt-user-ubuntu
2018-01-25 07:35:25,848 [salt.state       ][INFO    ][27929] File /etc/sudoers.d/90-salt-user-ubuntu is in the correct state
2018-01-25 07:35:25,848 [salt.state       ][INFO    ][27929] Completed state [/etc/sudoers.d/90-salt-user-ubuntu] at time 07:35:25.848897 duration_in_ms=37.131
2018-01-25 07:35:25,849 [salt.state       ][INFO    ][27929] Running state [/etc/security/limits.d/90-salt-default.conf] at time 07:35:25.849830
2018-01-25 07:35:25,851 [salt.state       ][INFO    ][27929] Executing state file.managed for /etc/security/limits.d/90-salt-default.conf
2018-01-25 07:35:25,882 [salt.fileclient  ][INFO    ][27929] Fetching file from saltenv 'base', ** done ** 'linux/files/limits.conf'
2018-01-25 07:35:25,979 [salt.state       ][INFO    ][27929] File changed:
New file
2018-01-25 07:35:25,980 [salt.state       ][INFO    ][27929] Completed state [/etc/security/limits.d/90-salt-default.conf] at time 07:35:25.980704 duration_in_ms=130.874
2018-01-25 07:35:25,981 [salt.state       ][INFO    ][27929] Running state [/etc/systemd/system.conf.d/90-salt.conf] at time 07:35:25.981245
2018-01-25 07:35:25,981 [salt.state       ][INFO    ][27929] Executing state file.managed for /etc/systemd/system.conf.d/90-salt.conf
2018-01-25 07:35:26,010 [salt.fileclient  ][INFO    ][27929] Fetching file from saltenv 'base', ** done ** 'linux/files/systemd.conf'
2018-01-25 07:35:26,095 [salt.state       ][INFO    ][27929] File changed:
New file
2018-01-25 07:35:26,096 [salt.state       ][INFO    ][27929] Completed state [/etc/systemd/system.conf.d/90-salt.conf] at time 07:35:26.096844 duration_in_ms=115.598
2018-01-25 07:35:26,100 [salt.state       ][INFO    ][27929] Running state [service.systemctl_reload] at time 07:35:26.100207
2018-01-25 07:35:26,101 [salt.state       ][INFO    ][27929] Executing state module.wait for service.systemctl_reload
2018-01-25 07:35:26,102 [salt.state       ][INFO    ][27929] No changes made for service.systemctl_reload
2018-01-25 07:35:26,103 [salt.state       ][INFO    ][27929] Completed state [service.systemctl_reload] at time 07:35:26.103442 duration_in_ms=3.235
2018-01-25 07:35:26,104 [salt.state       ][INFO    ][27929] Running state [service.systemctl_reload] at time 07:35:26.104068
2018-01-25 07:35:26,104 [salt.state       ][INFO    ][27929] Executing state module.mod_watch for service.systemctl_reload
2018-01-25 07:35:26,105 [salt.loaded.int.module.cmdmod][INFO    ][27929] Executing command ['systemctl', '--system', 'daemon-reload'] in directory '/root'
2018-01-25 07:35:26,186 [salt.state       ][INFO    ][27929] {'ret': True}
2018-01-25 07:35:26,187 [salt.state       ][INFO    ][27929] Completed state [service.systemctl_reload] at time 07:35:26.187284 duration_in_ms=83.216
2018-01-25 07:35:26,187 [salt.state       ][INFO    ][27929] Running state [/etc/hostname] at time 07:35:26.187796
2018-01-25 07:35:26,188 [salt.state       ][INFO    ][27929] Executing state file.managed for /etc/hostname
2018-01-25 07:35:26,232 [salt.fileclient  ][INFO    ][27929] Fetching file from saltenv 'base', ** done ** 'linux/files/hostname'
2018-01-25 07:35:26,237 [salt.state       ][INFO    ][27929] File /etc/hostname is in the correct state
2018-01-25 07:35:26,237 [salt.state       ][INFO    ][27929] Completed state [/etc/hostname] at time 07:35:26.237724 duration_in_ms=49.927
2018-01-25 07:35:26,241 [salt.state       ][INFO    ][27929] Running state [hostname cfg01] at time 07:35:26.241906
2018-01-25 07:35:26,242 [salt.state       ][INFO    ][27929] Executing state cmd.wait for hostname cfg01
2018-01-25 07:35:26,243 [salt.state       ][INFO    ][27929] No changes made for hostname cfg01
2018-01-25 07:35:26,243 [salt.state       ][INFO    ][27929] Completed state [hostname cfg01] at time 07:35:26.243408 duration_in_ms=1.502
2018-01-25 07:35:26,245 [salt.state       ][INFO    ][27929] Running state [mdb02] at time 07:35:26.245055
2018-01-25 07:35:26,245 [salt.state       ][INFO    ][27929] Executing state host.present for mdb02
2018-01-25 07:35:26,246 [salt.state       ][INFO    ][27929] {'host': 'mdb02'}
2018-01-25 07:35:26,247 [salt.state       ][INFO    ][27929] Completed state [mdb02] at time 07:35:26.247012 duration_in_ms=1.957
2018-01-25 07:35:26,247 [salt.state       ][INFO    ][27929] Running state [mdb02.baremetal-mcp-pike-odl-ha.local] at time 07:35:26.247288
2018-01-25 07:35:26,247 [salt.state       ][INFO    ][27929] Executing state host.present for mdb02.baremetal-mcp-pike-odl-ha.local
2018-01-25 07:35:26,248 [salt.state       ][INFO    ][27929] {'host': 'mdb02.baremetal-mcp-pike-odl-ha.local'}
2018-01-25 07:35:26,248 [salt.state       ][INFO    ][27929] Completed state [mdb02.baremetal-mcp-pike-odl-ha.local] at time 07:35:26.248697 duration_in_ms=1.409
2018-01-25 07:35:26,248 [salt.state       ][INFO    ][27929] Running state [mdb03] at time 07:35:26.248946
2018-01-25 07:35:26,249 [salt.state       ][INFO    ][27929] Executing state host.present for mdb03
2018-01-25 07:35:26,250 [salt.state       ][INFO    ][27929] {'host': 'mdb03'}
2018-01-25 07:35:26,250 [salt.state       ][INFO    ][27929] Completed state [mdb03] at time 07:35:26.250575 duration_in_ms=1.629
2018-01-25 07:35:26,250 [salt.state       ][INFO    ][27929] Running state [mdb03.baremetal-mcp-pike-odl-ha.local] at time 07:35:26.250817
2018-01-25 07:35:26,251 [salt.state       ][INFO    ][27929] Executing state host.present for mdb03.baremetal-mcp-pike-odl-ha.local
2018-01-25 07:35:26,251 [salt.state       ][INFO    ][27929] {'host': 'mdb03.baremetal-mcp-pike-odl-ha.local'}
2018-01-25 07:35:26,252 [salt.state       ][INFO    ][27929] Completed state [mdb03.baremetal-mcp-pike-odl-ha.local] at time 07:35:26.252185 duration_in_ms=1.368
2018-01-25 07:35:26,252 [salt.state       ][INFO    ][27929] Running state [mdb01] at time 07:35:26.252434
2018-01-25 07:35:26,252 [salt.state       ][INFO    ][27929] Executing state host.present for mdb01
2018-01-25 07:35:26,253 [salt.state       ][INFO    ][27929] {'host': 'mdb01'}
2018-01-25 07:35:26,253 [salt.state       ][INFO    ][27929] Completed state [mdb01] at time 07:35:26.253733 duration_in_ms=1.3
2018-01-25 07:35:26,254 [salt.state       ][INFO    ][27929] Running state [mdb01.baremetal-mcp-pike-odl-ha.local] at time 07:35:26.253981
2018-01-25 07:35:26,254 [salt.state       ][INFO    ][27929] Executing state host.present for mdb01.baremetal-mcp-pike-odl-ha.local
2018-01-25 07:35:26,255 [salt.state       ][INFO    ][27929] {'host': 'mdb01.baremetal-mcp-pike-odl-ha.local'}
2018-01-25 07:35:26,255 [salt.state       ][INFO    ][27929] Completed state [mdb01.baremetal-mcp-pike-odl-ha.local] at time 07:35:26.255671 duration_in_ms=1.69
2018-01-25 07:35:26,255 [salt.state       ][INFO    ][27929] Running state [mdb] at time 07:35:26.255919
2018-01-25 07:35:26,256 [salt.state       ][INFO    ][27929] Executing state host.present for mdb
2018-01-25 07:35:26,257 [salt.state       ][INFO    ][27929] {'host': 'mdb'}
2018-01-25 07:35:26,257 [salt.state       ][INFO    ][27929] Completed state [mdb] at time 07:35:26.257257 duration_in_ms=1.338
2018-01-25 07:35:26,257 [salt.state       ][INFO    ][27929] Running state [mdb.baremetal-mcp-pike-odl-ha.local] at time 07:35:26.257511
2018-01-25 07:35:26,257 [salt.state       ][INFO    ][27929] Executing state host.present for mdb.baremetal-mcp-pike-odl-ha.local
2018-01-25 07:35:26,258 [salt.state       ][INFO    ][27929] {'host': 'mdb.baremetal-mcp-pike-odl-ha.local'}
2018-01-25 07:35:26,259 [salt.state       ][INFO    ][27929] Completed state [mdb.baremetal-mcp-pike-odl-ha.local] at time 07:35:26.259185 duration_in_ms=1.674
2018-01-25 07:35:26,259 [salt.state       ][INFO    ][27929] Running state [cfg01] at time 07:35:26.259430
2018-01-25 07:35:26,259 [salt.state       ][INFO    ][27929] Executing state host.present for cfg01
2018-01-25 07:35:26,260 [salt.state       ][INFO    ][27929] {'host': 'cfg01'}
2018-01-25 07:35:26,260 [salt.state       ][INFO    ][27929] Completed state [cfg01] at time 07:35:26.260838 duration_in_ms=1.408
2018-01-25 07:35:26,261 [salt.state       ][INFO    ][27929] Running state [cfg01.baremetal-mcp-pike-odl-ha.local] at time 07:35:26.261081
2018-01-25 07:35:26,261 [salt.state       ][INFO    ][27929] Executing state host.present for cfg01.baremetal-mcp-pike-odl-ha.local
2018-01-25 07:35:26,262 [salt.state       ][INFO    ][27929] {'host': 'cfg01.baremetal-mcp-pike-odl-ha.local'}
2018-01-25 07:35:26,262 [salt.state       ][INFO    ][27929] Completed state [cfg01.baremetal-mcp-pike-odl-ha.local] at time 07:35:26.262460 duration_in_ms=1.379
2018-01-25 07:35:26,262 [salt.state       ][INFO    ][27929] Running state [prx01] at time 07:35:26.262717
2018-01-25 07:35:26,262 [salt.state       ][INFO    ][27929] Executing state host.present for prx01
2018-01-25 07:35:26,263 [salt.state       ][INFO    ][27929] {'host': 'prx01'}
2018-01-25 07:35:26,264 [salt.state       ][INFO    ][27929] Completed state [prx01] at time 07:35:26.264123 duration_in_ms=1.406
2018-01-25 07:35:26,264 [salt.state       ][INFO    ][27929] Running state [prx01.baremetal-mcp-pike-odl-ha.local] at time 07:35:26.264364
2018-01-25 07:35:26,264 [salt.state       ][INFO    ][27929] Executing state host.present for prx01.baremetal-mcp-pike-odl-ha.local
2018-01-25 07:35:26,265 [salt.state       ][INFO    ][27929] {'host': 'prx01.baremetal-mcp-pike-odl-ha.local'}
2018-01-25 07:35:26,265 [salt.state       ][INFO    ][27929] Completed state [prx01.baremetal-mcp-pike-odl-ha.local] at time 07:35:26.265738 duration_in_ms=1.373
2018-01-25 07:35:26,266 [salt.state       ][INFO    ][27929] Running state [kvm01] at time 07:35:26.265987
2018-01-25 07:35:26,266 [salt.state       ][INFO    ][27929] Executing state host.present for kvm01
2018-01-25 07:35:26,267 [salt.state       ][INFO    ][27929] {'host': 'kvm01'}
2018-01-25 07:35:26,267 [salt.state       ][INFO    ][27929] Completed state [kvm01] at time 07:35:26.267373 duration_in_ms=1.386
2018-01-25 07:35:26,267 [salt.state       ][INFO    ][27929] Running state [kvm01.baremetal-mcp-pike-odl-ha.local] at time 07:35:26.267661
2018-01-25 07:35:26,267 [salt.state       ][INFO    ][27929] Executing state host.present for kvm01.baremetal-mcp-pike-odl-ha.local
2018-01-25 07:35:26,268 [salt.state       ][INFO    ][27929] {'host': 'kvm01.baremetal-mcp-pike-odl-ha.local'}
2018-01-25 07:35:26,269 [salt.state       ][INFO    ][27929] Completed state [kvm01.baremetal-mcp-pike-odl-ha.local] at time 07:35:26.269060 duration_in_ms=1.398
2018-01-25 07:35:26,269 [salt.state       ][INFO    ][27929] Running state [kvm03] at time 07:35:26.269303
2018-01-25 07:35:26,269 [salt.state       ][INFO    ][27929] Executing state host.present for kvm03
2018-01-25 07:35:26,271 [salt.state       ][INFO    ][27929] {'host': 'kvm03'}
2018-01-25 07:35:26,271 [salt.state       ][INFO    ][27929] Completed state [kvm03] at time 07:35:26.271251 duration_in_ms=1.948
2018-01-25 07:35:26,271 [salt.state       ][INFO    ][27929] Running state [kvm03.baremetal-mcp-pike-odl-ha.local] at time 07:35:26.271536
2018-01-25 07:35:26,271 [salt.state       ][INFO    ][27929] Executing state host.present for kvm03.baremetal-mcp-pike-odl-ha.local
2018-01-25 07:35:26,272 [salt.state       ][INFO    ][27929] {'host': 'kvm03.baremetal-mcp-pike-odl-ha.local'}
2018-01-25 07:35:26,272 [salt.state       ][INFO    ][27929] Completed state [kvm03.baremetal-mcp-pike-odl-ha.local] at time 07:35:26.272929 duration_in_ms=1.393
2018-01-25 07:35:26,273 [salt.state       ][INFO    ][27929] Running state [kvm02] at time 07:35:26.273171
2018-01-25 07:35:26,273 [salt.state       ][INFO    ][27929] Executing state host.present for kvm02
2018-01-25 07:35:26,274 [salt.state       ][INFO    ][27929] {'host': 'kvm02'}
2018-01-25 07:35:26,274 [salt.state       ][INFO    ][27929] Completed state [kvm02] at time 07:35:26.274848 duration_in_ms=1.677
2018-01-25 07:35:26,275 [salt.state       ][INFO    ][27929] Running state [kvm02.baremetal-mcp-pike-odl-ha.local] at time 07:35:26.275116
2018-01-25 07:35:26,275 [salt.state       ][INFO    ][27929] Executing state host.present for kvm02.baremetal-mcp-pike-odl-ha.local
2018-01-25 07:35:26,276 [salt.state       ][INFO    ][27929] {'host': 'kvm02.baremetal-mcp-pike-odl-ha.local'}
2018-01-25 07:35:26,276 [salt.state       ][INFO    ][27929] Completed state [kvm02.baremetal-mcp-pike-odl-ha.local] at time 07:35:26.276558 duration_in_ms=1.442
2018-01-25 07:35:26,276 [salt.state       ][INFO    ][27929] Running state [dbs] at time 07:35:26.276802
2018-01-25 07:35:26,277 [salt.state       ][INFO    ][27929] Executing state host.present for dbs
2018-01-25 07:35:26,278 [salt.state       ][INFO    ][27929] {'host': 'dbs'}
2018-01-25 07:35:26,278 [salt.state       ][INFO    ][27929] Completed state [dbs] at time 07:35:26.278200 duration_in_ms=1.397
2018-01-25 07:35:26,278 [salt.state       ][INFO    ][27929] Running state [dbs.baremetal-mcp-pike-odl-ha.local] at time 07:35:26.278453
2018-01-25 07:35:26,278 [salt.state       ][INFO    ][27929] Executing state host.present for dbs.baremetal-mcp-pike-odl-ha.local
2018-01-25 07:35:26,279 [salt.state       ][INFO    ][27929] {'host': 'dbs.baremetal-mcp-pike-odl-ha.local'}
2018-01-25 07:35:26,279 [salt.state       ][INFO    ][27929] Completed state [dbs.baremetal-mcp-pike-odl-ha.local] at time 07:35:26.279917 duration_in_ms=1.464
2018-01-25 07:35:26,280 [salt.state       ][INFO    ][27929] Running state [prx] at time 07:35:26.280161
2018-01-25 07:35:26,280 [salt.state       ][INFO    ][27929] Executing state host.present for prx
2018-01-25 07:35:26,281 [salt.state       ][INFO    ][27929] {'host': 'prx'}
2018-01-25 07:35:26,281 [salt.state       ][INFO    ][27929] Completed state [prx] at time 07:35:26.281591 duration_in_ms=1.43
2018-01-25 07:35:26,281 [salt.state       ][INFO    ][27929] Running state [prx.baremetal-mcp-pike-odl-ha.local] at time 07:35:26.281842
2018-01-25 07:35:26,282 [salt.state       ][INFO    ][27929] Executing state host.present for prx.baremetal-mcp-pike-odl-ha.local
2018-01-25 07:35:26,283 [salt.state       ][INFO    ][27929] {'host': 'prx.baremetal-mcp-pike-odl-ha.local'}
2018-01-25 07:35:26,283 [salt.state       ][INFO    ][27929] Completed state [prx.baremetal-mcp-pike-odl-ha.local] at time 07:35:26.283627 duration_in_ms=1.785
2018-01-25 07:35:26,283 [salt.state       ][INFO    ][27929] Running state [prx02] at time 07:35:26.283872
2018-01-25 07:35:26,284 [salt.state       ][INFO    ][27929] Executing state host.present for prx02
2018-01-25 07:35:26,285 [salt.state       ][INFO    ][27929] {'host': 'prx02'}
2018-01-25 07:35:26,285 [salt.state       ][INFO    ][27929] Completed state [prx02] at time 07:35:26.285288 duration_in_ms=1.416
2018-01-25 07:35:26,285 [salt.state       ][INFO    ][27929] Running state [prx02.baremetal-mcp-pike-odl-ha.local] at time 07:35:26.285539
2018-01-25 07:35:26,285 [salt.state       ][INFO    ][27929] Executing state host.present for prx02.baremetal-mcp-pike-odl-ha.local
2018-01-25 07:35:26,286 [salt.state       ][INFO    ][27929] {'host': 'prx02.baremetal-mcp-pike-odl-ha.local'}
2018-01-25 07:35:26,287 [salt.state       ][INFO    ][27929] Completed state [prx02.baremetal-mcp-pike-odl-ha.local] at time 07:35:26.287000 duration_in_ms=1.461
2018-01-25 07:35:26,287 [salt.state       ][INFO    ][27929] Running state [msg02] at time 07:35:26.287255
2018-01-25 07:35:26,287 [salt.state       ][INFO    ][27929] Executing state host.present for msg02
2018-01-25 07:35:26,288 [salt.state       ][INFO    ][27929] {'host': 'msg02'}
2018-01-25 07:35:26,288 [salt.state       ][INFO    ][27929] Completed state [msg02] at time 07:35:26.288742 duration_in_ms=1.487
2018-01-25 07:35:26,289 [salt.state       ][INFO    ][27929] Running state [msg02.baremetal-mcp-pike-odl-ha.local] at time 07:35:26.288984
2018-01-25 07:35:26,289 [salt.state       ][INFO    ][27929] Executing state host.present for msg02.baremetal-mcp-pike-odl-ha.local
2018-01-25 07:35:26,290 [salt.state       ][INFO    ][27929] {'host': 'msg02.baremetal-mcp-pike-odl-ha.local'}
2018-01-25 07:35:26,290 [salt.state       ][INFO    ][27929] Completed state [msg02.baremetal-mcp-pike-odl-ha.local] at time 07:35:26.290501 duration_in_ms=1.517
2018-01-25 07:35:26,290 [salt.state       ][INFO    ][27929] Running state [msg03] at time 07:35:26.290762
2018-01-25 07:35:26,291 [salt.state       ][INFO    ][27929] Executing state host.present for msg03
2018-01-25 07:35:26,295 [salt.state       ][INFO    ][27929] {'host': 'msg03'}
2018-01-25 07:35:26,296 [salt.state       ][INFO    ][27929] Completed state [msg03] at time 07:35:26.296199 duration_in_ms=5.437
2018-01-25 07:35:26,296 [salt.state       ][INFO    ][27929] Running state [msg03.baremetal-mcp-pike-odl-ha.local] at time 07:35:26.296462
2018-01-25 07:35:26,296 [salt.state       ][INFO    ][27929] Executing state host.present for msg03.baremetal-mcp-pike-odl-ha.local
2018-01-25 07:35:26,297 [salt.state       ][INFO    ][27929] {'host': 'msg03.baremetal-mcp-pike-odl-ha.local'}
2018-01-25 07:35:26,298 [salt.state       ][INFO    ][27929] Completed state [msg03.baremetal-mcp-pike-odl-ha.local] at time 07:35:26.297986 duration_in_ms=1.524
2018-01-25 07:35:26,298 [salt.state       ][INFO    ][27929] Running state [msg01] at time 07:35:26.298544
2018-01-25 07:35:26,298 [salt.state       ][INFO    ][27929] Executing state host.present for msg01
2018-01-25 07:35:26,299 [salt.state       ][INFO    ][27929] {'host': 'msg01'}
2018-01-25 07:35:26,300 [salt.state       ][INFO    ][27929] Completed state [msg01] at time 07:35:26.300053 duration_in_ms=1.509
2018-01-25 07:35:26,300 [salt.state       ][INFO    ][27929] Running state [msg01.baremetal-mcp-pike-odl-ha.local] at time 07:35:26.300308
2018-01-25 07:35:26,300 [salt.state       ][INFO    ][27929] Executing state host.present for msg01.baremetal-mcp-pike-odl-ha.local
2018-01-25 07:35:26,301 [salt.state       ][INFO    ][27929] {'host': 'msg01.baremetal-mcp-pike-odl-ha.local'}
2018-01-25 07:35:26,301 [salt.state       ][INFO    ][27929] Completed state [msg01.baremetal-mcp-pike-odl-ha.local] at time 07:35:26.301797 duration_in_ms=1.489
2018-01-25 07:35:26,302 [salt.state       ][INFO    ][27929] Running state [msg] at time 07:35:26.302053
2018-01-25 07:35:26,302 [salt.state       ][INFO    ][27929] Executing state host.present for msg
2018-01-25 07:35:26,303 [salt.state       ][INFO    ][27929] {'host': 'msg'}
2018-01-25 07:35:26,303 [salt.state       ][INFO    ][27929] Completed state [msg] at time 07:35:26.303584 duration_in_ms=1.53
2018-01-25 07:35:26,303 [salt.state       ][INFO    ][27929] Running state [msg.baremetal-mcp-pike-odl-ha.local] at time 07:35:26.303829
2018-01-25 07:35:26,304 [salt.state       ][INFO    ][27929] Executing state host.present for msg.baremetal-mcp-pike-odl-ha.local
2018-01-25 07:35:26,305 [salt.state       ][INFO    ][27929] {'host': 'msg.baremetal-mcp-pike-odl-ha.local'}
2018-01-25 07:35:26,305 [salt.state       ][INFO    ][27929] Completed state [msg.baremetal-mcp-pike-odl-ha.local] at time 07:35:26.305354 duration_in_ms=1.525
2018-01-25 07:35:26,305 [salt.state       ][INFO    ][27929] Running state [cfg01] at time 07:35:26.305619
2018-01-25 07:35:26,305 [salt.state       ][INFO    ][27929] Executing state host.present for cfg01
2018-01-25 07:35:26,306 [salt.state       ][INFO    ][27929] Host cfg01 (192.168.10.100) already present
2018-01-25 07:35:26,307 [salt.state       ][INFO    ][27929] Completed state [cfg01] at time 07:35:26.307105 duration_in_ms=1.486
2018-01-25 07:35:26,307 [salt.state       ][INFO    ][27929] Running state [cfg01.baremetal-mcp-pike-odl-ha.local] at time 07:35:26.307346
2018-01-25 07:35:26,307 [salt.state       ][INFO    ][27929] Executing state host.present for cfg01.baremetal-mcp-pike-odl-ha.local
2018-01-25 07:35:26,308 [salt.state       ][INFO    ][27929] Host cfg01.baremetal-mcp-pike-odl-ha.local (192.168.10.100) already present
2018-01-25 07:35:26,308 [salt.state       ][INFO    ][27929] Completed state [cfg01.baremetal-mcp-pike-odl-ha.local] at time 07:35:26.308258 duration_in_ms=0.912
2018-01-25 07:35:26,308 [salt.state       ][INFO    ][27929] Running state [cmp002] at time 07:35:26.308510
2018-01-25 07:35:26,308 [salt.state       ][INFO    ][27929] Executing state host.present for cmp002
2018-01-25 07:35:26,309 [salt.state       ][INFO    ][27929] {'host': 'cmp002'}
2018-01-25 07:35:26,310 [salt.state       ][INFO    ][27929] Completed state [cmp002] at time 07:35:26.310010 duration_in_ms=1.5
2018-01-25 07:35:26,310 [salt.state       ][INFO    ][27929] Running state [cmp002.baremetal-mcp-pike-odl-ha.local] at time 07:35:26.310290
2018-01-25 07:35:26,310 [salt.state       ][INFO    ][27929] Executing state host.present for cmp002.baremetal-mcp-pike-odl-ha.local
2018-01-25 07:35:26,311 [salt.state       ][INFO    ][27929] {'host': 'cmp002.baremetal-mcp-pike-odl-ha.local'}
2018-01-25 07:35:26,312 [salt.state       ][INFO    ][27929] Completed state [cmp002.baremetal-mcp-pike-odl-ha.local] at time 07:35:26.312166 duration_in_ms=1.876
2018-01-25 07:35:26,312 [salt.state       ][INFO    ][27929] Running state [cmp001] at time 07:35:26.312430
2018-01-25 07:35:26,312 [salt.state       ][INFO    ][27929] Executing state host.present for cmp001
2018-01-25 07:35:26,313 [salt.state       ][INFO    ][27929] {'host': 'cmp001'}
2018-01-25 07:35:26,314 [salt.state       ][INFO    ][27929] Completed state [cmp001] at time 07:35:26.313978 duration_in_ms=1.548
2018-01-25 07:35:26,314 [salt.state       ][INFO    ][27929] Running state [cmp001.baremetal-mcp-pike-odl-ha.local] at time 07:35:26.314247
2018-01-25 07:35:26,314 [salt.state       ][INFO    ][27929] Executing state host.present for cmp001.baremetal-mcp-pike-odl-ha.local
2018-01-25 07:35:26,315 [salt.state       ][INFO    ][27929] {'host': 'cmp001.baremetal-mcp-pike-odl-ha.local'}
2018-01-25 07:35:26,316 [salt.state       ][INFO    ][27929] Completed state [cmp001.baremetal-mcp-pike-odl-ha.local] at time 07:35:26.315972 duration_in_ms=1.725
2018-01-25 07:35:26,316 [salt.state       ][INFO    ][27929] Running state [dbs01] at time 07:35:26.316220
2018-01-25 07:35:26,316 [salt.state       ][INFO    ][27929] Executing state host.present for dbs01
2018-01-25 07:35:26,317 [salt.state       ][INFO    ][27929] {'host': 'dbs01'}
2018-01-25 07:35:26,317 [salt.state       ][INFO    ][27929] Completed state [dbs01] at time 07:35:26.317769 duration_in_ms=1.549
2018-01-25 07:35:26,318 [salt.state       ][INFO    ][27929] Running state [dbs01.baremetal-mcp-pike-odl-ha.local] at time 07:35:26.318029
2018-01-25 07:35:26,318 [salt.state       ][INFO    ][27929] Executing state host.present for dbs01.baremetal-mcp-pike-odl-ha.local
2018-01-25 07:35:26,320 [salt.state       ][INFO    ][27929] {'host': 'dbs01.baremetal-mcp-pike-odl-ha.local'}
2018-01-25 07:35:26,320 [salt.state       ][INFO    ][27929] Completed state [dbs01.baremetal-mcp-pike-odl-ha.local] at time 07:35:26.320231 duration_in_ms=2.202
2018-01-25 07:35:26,320 [salt.state       ][INFO    ][27929] Running state [dbs02] at time 07:35:26.320489
2018-01-25 07:35:26,320 [salt.state       ][INFO    ][27929] Executing state host.present for dbs02
2018-01-25 07:35:26,321 [salt.state       ][INFO    ][27929] {'host': 'dbs02'}
2018-01-25 07:35:26,322 [salt.state       ][INFO    ][27929] Completed state [dbs02] at time 07:35:26.322045 duration_in_ms=1.556
2018-01-25 07:35:26,322 [salt.state       ][INFO    ][27929] Running state [dbs02.baremetal-mcp-pike-odl-ha.local] at time 07:35:26.322317
2018-01-25 07:35:26,322 [salt.state       ][INFO    ][27929] Executing state host.present for dbs02.baremetal-mcp-pike-odl-ha.local
2018-01-25 07:35:26,323 [salt.state       ][INFO    ][27929] {'host': 'dbs02.baremetal-mcp-pike-odl-ha.local'}
2018-01-25 07:35:26,323 [salt.state       ][INFO    ][27929] Completed state [dbs02.baremetal-mcp-pike-odl-ha.local] at time 07:35:26.323932 duration_in_ms=1.614
2018-01-25 07:35:26,324 [salt.state       ][INFO    ][27929] Running state [dbs03] at time 07:35:26.324190
2018-01-25 07:35:26,324 [salt.state       ][INFO    ][27929] Executing state host.present for dbs03
2018-01-25 07:35:26,325 [salt.state       ][INFO    ][27929] {'host': 'dbs03'}
2018-01-25 07:35:26,325 [salt.state       ][INFO    ][27929] Completed state [dbs03] at time 07:35:26.325780 duration_in_ms=1.59
2018-01-25 07:35:26,326 [salt.state       ][INFO    ][27929] Running state [dbs03.baremetal-mcp-pike-odl-ha.local] at time 07:35:26.326040
2018-01-25 07:35:26,326 [salt.state       ][INFO    ][27929] Executing state host.present for dbs03.baremetal-mcp-pike-odl-ha.local
2018-01-25 07:35:26,327 [salt.state       ][INFO    ][27929] {'host': 'dbs03.baremetal-mcp-pike-odl-ha.local'}
2018-01-25 07:35:26,327 [salt.state       ][INFO    ][27929] Completed state [dbs03.baremetal-mcp-pike-odl-ha.local] at time 07:35:26.327670 duration_in_ms=1.63
2018-01-25 07:35:26,327 [salt.state       ][INFO    ][27929] Running state [odl01] at time 07:35:26.327921
2018-01-25 07:35:26,328 [salt.state       ][INFO    ][27929] Executing state host.present for odl01
2018-01-25 07:35:26,329 [salt.state       ][INFO    ][27929] {'host': 'odl01'}
2018-01-25 07:35:26,329 [salt.state       ][INFO    ][27929] Completed state [odl01] at time 07:35:26.329502 duration_in_ms=1.581
2018-01-25 07:35:26,329 [salt.state       ][INFO    ][27929] Running state [odl01.baremetal-mcp-pike-odl-ha.local] at time 07:35:26.329747
2018-01-25 07:35:26,330 [salt.state       ][INFO    ][27929] Executing state host.present for odl01.baremetal-mcp-pike-odl-ha.local
2018-01-25 07:35:26,331 [salt.state       ][INFO    ][27929] {'host': 'odl01.baremetal-mcp-pike-odl-ha.local'}
2018-01-25 07:35:26,331 [salt.state       ][INFO    ][27929] Completed state [odl01.baremetal-mcp-pike-odl-ha.local] at time 07:35:26.331826 duration_in_ms=2.079
2018-01-25 07:35:26,332 [salt.state       ][INFO    ][27929] Running state [mas01] at time 07:35:26.332079
2018-01-25 07:35:26,332 [salt.state       ][INFO    ][27929] Executing state host.present for mas01
2018-01-25 07:35:26,333 [salt.state       ][INFO    ][27929] {'host': 'mas01'}
2018-01-25 07:35:26,333 [salt.state       ][INFO    ][27929] Completed state [mas01] at time 07:35:26.333701 duration_in_ms=1.622
2018-01-25 07:35:26,333 [salt.state       ][INFO    ][27929] Running state [mas01.baremetal-mcp-pike-odl-ha.local] at time 07:35:26.333945
2018-01-25 07:35:26,334 [salt.state       ][INFO    ][27929] Executing state host.present for mas01.baremetal-mcp-pike-odl-ha.local
2018-01-25 07:35:26,335 [salt.state       ][INFO    ][27929] {'host': 'mas01.baremetal-mcp-pike-odl-ha.local'}
2018-01-25 07:35:26,335 [salt.state       ][INFO    ][27929] Completed state [mas01.baremetal-mcp-pike-odl-ha.local] at time 07:35:26.335884 duration_in_ms=1.939
2018-01-25 07:35:26,336 [salt.state       ][INFO    ][27929] Running state [ctl02] at time 07:35:26.336148
2018-01-25 07:35:26,336 [salt.state       ][INFO    ][27929] Executing state host.present for ctl02
2018-01-25 07:35:26,337 [salt.state       ][INFO    ][27929] {'host': 'ctl02'}
2018-01-25 07:35:26,337 [salt.state       ][INFO    ][27929] Completed state [ctl02] at time 07:35:26.337776 duration_in_ms=1.628
2018-01-25 07:35:26,338 [salt.state       ][INFO    ][27929] Running state [ctl02.baremetal-mcp-pike-odl-ha.local] at time 07:35:26.338023
2018-01-25 07:35:26,338 [salt.state       ][INFO    ][27929] Executing state host.present for ctl02.baremetal-mcp-pike-odl-ha.local
2018-01-25 07:35:26,339 [salt.state       ][INFO    ][27929] {'host': 'ctl02.baremetal-mcp-pike-odl-ha.local'}
2018-01-25 07:35:26,339 [salt.state       ][INFO    ][27929] Completed state [ctl02.baremetal-mcp-pike-odl-ha.local] at time 07:35:26.339672 duration_in_ms=1.649
2018-01-25 07:35:26,339 [salt.state       ][INFO    ][27929] Running state [ctl03] at time 07:35:26.339932
2018-01-25 07:35:26,340 [salt.state       ][INFO    ][27929] Executing state host.present for ctl03
2018-01-25 07:35:26,341 [salt.state       ][INFO    ][27929] {'host': 'ctl03'}
2018-01-25 07:35:26,341 [salt.state       ][INFO    ][27929] Completed state [ctl03] at time 07:35:26.341544 duration_in_ms=1.612
2018-01-25 07:35:26,341 [salt.state       ][INFO    ][27929] Running state [ctl03.baremetal-mcp-pike-odl-ha.local] at time 07:35:26.341808
2018-01-25 07:35:26,342 [salt.state       ][INFO    ][27929] Executing state host.present for ctl03.baremetal-mcp-pike-odl-ha.local
2018-01-25 07:35:26,343 [salt.state       ][INFO    ][27929] {'host': 'ctl03.baremetal-mcp-pike-odl-ha.local'}
2018-01-25 07:35:26,344 [salt.state       ][INFO    ][27929] Completed state [ctl03.baremetal-mcp-pike-odl-ha.local] at time 07:35:26.344042 duration_in_ms=2.234
2018-01-25 07:35:26,344 [salt.state       ][INFO    ][27929] Running state [ctl01] at time 07:35:26.344290
2018-01-25 07:35:26,344 [salt.state       ][INFO    ][27929] Executing state host.present for ctl01
2018-01-25 07:35:26,345 [salt.state       ][INFO    ][27929] {'host': 'ctl01'}
2018-01-25 07:35:26,345 [salt.state       ][INFO    ][27929] Completed state [ctl01] at time 07:35:26.345920 duration_in_ms=1.63
2018-01-25 07:35:26,346 [salt.state       ][INFO    ][27929] Running state [ctl01.baremetal-mcp-pike-odl-ha.local] at time 07:35:26.346459
2018-01-25 07:35:26,346 [salt.state       ][INFO    ][27929] Executing state host.present for ctl01.baremetal-mcp-pike-odl-ha.local
2018-01-25 07:35:26,348 [salt.state       ][INFO    ][27929] {'host': 'ctl01.baremetal-mcp-pike-odl-ha.local'}
2018-01-25 07:35:26,348 [salt.state       ][INFO    ][27929] Completed state [ctl01.baremetal-mcp-pike-odl-ha.local] at time 07:35:26.348269 duration_in_ms=1.81
2018-01-25 07:35:26,348 [salt.state       ][INFO    ][27929] Running state [ctl] at time 07:35:26.348518
2018-01-25 07:35:26,348 [salt.state       ][INFO    ][27929] Executing state host.present for ctl
2018-01-25 07:35:26,349 [salt.state       ][INFO    ][27929] {'host': 'ctl'}
2018-01-25 07:35:26,350 [salt.state       ][INFO    ][27929] Completed state [ctl] at time 07:35:26.350453 duration_in_ms=1.935
2018-01-25 07:35:26,350 [salt.state       ][INFO    ][27929] Running state [ctl.baremetal-mcp-pike-odl-ha.local] at time 07:35:26.350698
2018-01-25 07:35:26,350 [salt.state       ][INFO    ][27929] Executing state host.present for ctl.baremetal-mcp-pike-odl-ha.local
2018-01-25 07:35:26,352 [salt.state       ][INFO    ][27929] {'host': 'ctl.baremetal-mcp-pike-odl-ha.local'}
2018-01-25 07:35:26,352 [salt.state       ][INFO    ][27929] Completed state [ctl.baremetal-mcp-pike-odl-ha.local] at time 07:35:26.352380 duration_in_ms=1.681
2018-01-25 07:35:26,352 [salt.state       ][INFO    ][27929] Running state [/etc/network/interfaces.d/50-cloud-init.cfg] at time 07:35:26.352624
2018-01-25 07:35:26,352 [salt.state       ][INFO    ][27929] Executing state file.absent for /etc/network/interfaces.d/50-cloud-init.cfg
2018-01-25 07:35:26,353 [salt.state       ][INFO    ][27929] {'removed': '/etc/network/interfaces.d/50-cloud-init.cfg'}
2018-01-25 07:35:26,354 [salt.state       ][INFO    ][27929] Completed state [/etc/network/interfaces.d/50-cloud-init.cfg] at time 07:35:26.354793 duration_in_ms=2.169
2018-01-25 07:35:26,368 [salt.state       ][INFO    ][27929] Running state [ens3] at time 07:35:26.368424
2018-01-25 07:35:26,368 [salt.state       ][INFO    ][27929] Executing state network.managed for ens3
2018-01-25 07:35:26,497 [salt.minion      ][INFO    ][27383] User sudo_ubuntu Executing command saltutil.find_job with jid 20180125073526488689
2018-01-25 07:35:26,519 [salt.minion      ][INFO    ][31543] Starting a new job with PID 31543
2018-01-25 07:35:26,526 [salt.loaded.int.module.cmdmod][INFO    ][27929] Executing command ['ifdown', 'ens3'] in directory '/root'
2018-01-25 07:35:26,542 [salt.minion      ][INFO    ][31543] Returning information for job: 20180125073526488689
2018-01-25 07:35:27,701 [salt.loaded.int.module.cmdmod][INFO    ][27929] Executing command ['ifup', 'ens3'] in directory '/root'
2018-01-25 07:35:27,901 [salt.state       ][INFO    ][27929] {'interface': 'Added network interface.', 'status': 'Interface ens3 restart to validate'}
2018-01-25 07:35:27,903 [salt.state       ][INFO    ][27929] Completed state [ens3] at time 07:35:27.902990 duration_in_ms=1534.564
2018-01-25 07:35:27,903 [salt.state       ][INFO    ][27929] Running state [ens4] at time 07:35:27.903862
2018-01-25 07:35:27,904 [salt.state       ][INFO    ][27929] Executing state network.managed for ens4
2018-01-25 07:35:27,941 [salt.loaded.int.module.cmdmod][INFO    ][27929] Executing command ['ifup', 'ens4'] in directory '/root'
2018-01-25 07:35:28,825 [salt.state       ][INFO    ][27929] {'interface': 'Added network interface.', 'status': 'Interface ens4 is up'}
2018-01-25 07:35:28,826 [salt.state       ][INFO    ][27929] Completed state [ens4] at time 07:35:28.826083 duration_in_ms=922.221
2018-01-25 07:35:28,827 [salt.state       ][INFO    ][27929] Running state [ens5] at time 07:35:28.827005
2018-01-25 07:35:28,827 [salt.state       ][INFO    ][27929] Executing state network.managed for ens5
2018-01-25 07:35:28,853 [salt.loaded.int.module.cmdmod][INFO    ][27929] Executing command ['ifup', 'ens5'] in directory '/root'
2018-01-25 07:35:29,602 [salt.state       ][INFO    ][27929] {'interface': 'Added network interface.', 'status': 'Interface ens5 is up'}
2018-01-25 07:35:29,602 [salt.state       ][INFO    ][27929] Completed state [ens5] at time 07:35:29.602657 duration_in_ms=775.653
2018-01-25 07:35:29,603 [salt.state       ][INFO    ][27929] Running state [/etc/profile.d/proxy.sh] at time 07:35:29.603083
2018-01-25 07:35:29,603 [salt.state       ][INFO    ][27929] Executing state file.absent for /etc/profile.d/proxy.sh
2018-01-25 07:35:29,604 [salt.state       ][INFO    ][27929] File /etc/profile.d/proxy.sh is not present
2018-01-25 07:35:29,604 [salt.state       ][INFO    ][27929] Completed state [/etc/profile.d/proxy.sh] at time 07:35:29.604293 duration_in_ms=1.21
2018-01-25 07:35:29,604 [salt.state       ][INFO    ][27929] Running state [/etc/apt/apt.conf.d/95proxies] at time 07:35:29.604578
2018-01-25 07:35:29,604 [salt.state       ][INFO    ][27929] Executing state file.absent for /etc/apt/apt.conf.d/95proxies
2018-01-25 07:35:29,605 [salt.state       ][INFO    ][27929] File /etc/apt/apt.conf.d/95proxies is not present
2018-01-25 07:35:29,605 [salt.state       ][INFO    ][27929] Completed state [/etc/apt/apt.conf.d/95proxies] at time 07:35:29.605384 duration_in_ms=0.806
2018-01-25 07:35:29,610 [salt.minion      ][INFO    ][27929] Returning information for job: 20180125073445962811
2018-01-25 07:36:11,333 [salt.minion      ][INFO    ][27383] User sudo_ubuntu Executing command state.sls with jid 20180125073611321819
2018-01-25 07:36:11,377 [salt.minion      ][INFO    ][32001] Starting a new job with PID 32001
2018-01-25 07:36:14,105 [salt.state       ][INFO    ][32001] Loading fresh modules for state activity
2018-01-25 07:36:14,153 [salt.fileclient  ][INFO    ][32001] Fetching file from saltenv 'base', ** done ** 'ntp/init.sls'
2018-01-25 07:36:14,181 [salt.fileclient  ][INFO    ][32001] Fetching file from saltenv 'base', ** done ** 'ntp/client.sls'
2018-01-25 07:36:14,242 [salt.fileclient  ][INFO    ][32001] Fetching file from saltenv 'base', ** done ** 'ntp/server.sls'
2018-01-25 07:36:14,869 [salt.state       ][INFO    ][32001] Running state [ntp] at time 07:36:14.869144
2018-01-25 07:36:14,870 [salt.state       ][INFO    ][32001] Executing state pkg.installed for ntp
2018-01-25 07:36:14,870 [salt.loaded.int.module.cmdmod][INFO    ][32001] Executing command ['dpkg-query', '--showformat', '${Status} ${Package} ${Version} ${Architecture}\n', '-W'] in directory '/root'
2018-01-25 07:36:15,354 [salt.loaded.int.module.cmdmod][INFO    ][32001] Executing command ['apt-cache', '-q', 'policy', 'ntp'] in directory '/root'
2018-01-25 07:36:15,433 [salt.loaded.int.module.cmdmod][INFO    ][32001] Executing command ['apt-get', '-q', 'update'] in directory '/root'
2018-01-25 07:36:17,712 [salt.loaded.int.module.cmdmod][INFO    ][32001] Executing command ['dpkg', '--get-selections', '*'] in directory '/root'
2018-01-25 07:36:17,736 [salt.loaded.int.module.cmdmod][INFO    ][32001] Executing command ['systemd-run', '--scope', 'apt-get', '-q', '-y', '-o', 'DPkg::Options::=--force-confold', '-o', 'DPkg::Options::=--force-confdef', 'install', 'ntp'] in directory '/root'
2018-01-25 07:36:21,667 [salt.minion      ][INFO    ][27383] User sudo_ubuntu Executing command saltutil.find_job with jid 20180125073621655420
2018-01-25 07:36:21,715 [salt.minion      ][INFO    ][690] Starting a new job with PID 690
2018-01-25 07:36:21,739 [salt.minion      ][INFO    ][690] Returning information for job: 20180125073621655420
2018-01-25 07:36:22,731 [salt.loaded.int.module.cmdmod][INFO    ][32001] Executing command ['dpkg-query', '--showformat', '${Status} ${Package} ${Version} ${Architecture}\n', '-W'] in directory '/root'
2018-01-25 07:36:22,774 [salt.state       ][INFO    ][32001] Made the following changes:
'ntp' changed from 'absent' to '1:4.2.8p4+dfsg-3ubuntu5.7'
'libopts25' changed from 'absent' to '1:5.18.7-3'

2018-01-25 07:36:22,799 [salt.state       ][INFO    ][32001] Loading fresh modules for state activity
2018-01-25 07:36:22,836 [salt.state       ][INFO    ][32001] Completed state [ntp] at time 07:36:22.836260 duration_in_ms=7967.117
2018-01-25 07:36:22,841 [salt.state       ][INFO    ][32001] Running state [/etc/ntp.conf] at time 07:36:22.841610
2018-01-25 07:36:22,842 [salt.state       ][INFO    ][32001] Executing state file.managed for /etc/ntp.conf
2018-01-25 07:36:22,874 [salt.fileclient  ][INFO    ][32001] Fetching file from saltenv 'base', ** done ** 'ntp/files/ntp.conf'
2018-01-25 07:36:22,924 [salt.state       ][INFO    ][32001] 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
2018-01-25 07:36:22,924 [salt.state       ][INFO    ][32001] Completed state [/etc/ntp.conf] at time 07:36:22.924761 duration_in_ms=83.151
2018-01-25 07:36:22,986 [salt.state       ][INFO    ][32001] Running state [ntp] at time 07:36:22.986076
2018-01-25 07:36:22,986 [salt.state       ][INFO    ][32001] Executing state service.running for ntp
2018-01-25 07:36:22,989 [salt.loaded.int.module.cmdmod][INFO    ][32001] Executing command ['systemctl', 'status', 'ntp.service', '-n', '0'] in directory '/root'
2018-01-25 07:36:23,010 [salt.loaded.int.module.cmdmod][INFO    ][32001] Executing command ['systemctl', 'is-active', 'ntp.service'] in directory '/root'
2018-01-25 07:36:23,027 [salt.loaded.int.module.cmdmod][INFO    ][32001] Executing command ['systemctl', 'is-enabled', 'ntp.service'] in directory '/root'
2018-01-25 07:36:23,046 [salt.state       ][INFO    ][32001] The service ntp is already running
2018-01-25 07:36:23,048 [salt.state       ][INFO    ][32001] Completed state [ntp] at time 07:36:23.048293 duration_in_ms=62.218
2018-01-25 07:36:23,048 [salt.state       ][INFO    ][32001] Running state [ntp] at time 07:36:23.048858
2018-01-25 07:36:23,049 [salt.state       ][INFO    ][32001] Executing state service.mod_watch for ntp
2018-01-25 07:36:23,050 [salt.loaded.int.module.cmdmod][INFO    ][32001] Executing command ['systemctl', 'is-active', 'ntp.service'] in directory '/root'
2018-01-25 07:36:23,066 [salt.loaded.int.module.cmdmod][INFO    ][32001] Executing command ['systemctl', 'is-enabled', 'ntp.service'] in directory '/root'
2018-01-25 07:36:23,091 [salt.loaded.int.module.cmdmod][INFO    ][32001] Executing command ['systemd-run', '--scope', 'systemctl', 'restart', 'ntp.service'] in directory '/root'
2018-01-25 07:36:23,204 [salt.state       ][INFO    ][32001] {'ntp': True}
2018-01-25 07:36:23,205 [salt.state       ][INFO    ][32001] Completed state [ntp] at time 07:36:23.205000 duration_in_ms=156.142
2018-01-25 07:36:23,207 [salt.minion      ][INFO    ][32001] Returning information for job: 20180125073611321819
2018-01-25 08:14:36,235 [salt.minion      ][INFO    ][27383] User root Executing command x509.sign_remote_certificate with jid 20180125081436221679
2018-01-25 08:14:37,932 [salt.minion      ][INFO    ][5253] Starting a new job with PID 5253
2018-01-25 08:14:38,386 [salt.minion      ][INFO    ][5253] Returning information for job: 20180125081436221679
2018-01-25 08:14:38,426 [salt.minion      ][INFO    ][27383] User root Executing command x509.sign_remote_certificate with jid 20180125081438406418
2018-01-25 08:14:38,545 [salt.minion      ][INFO    ][5262] Starting a new job with PID 5262
2018-01-25 08:14:38,596 [salt.minion      ][INFO    ][5262] Returning information for job: 20180125081438406418
2018-01-25 08:14:38,739 [salt.minion      ][INFO    ][27383] User root Executing command x509.sign_remote_certificate with jid 20180125081438729573
2018-01-25 08:14:38,764 [salt.minion      ][INFO    ][5271] Starting a new job with PID 5271
2018-01-25 08:14:38,842 [salt.minion      ][INFO    ][27383] User root Executing command x509.sign_remote_certificate with jid 20180125081438815757
2018-01-25 08:14:38,888 [salt.minion      ][INFO    ][5271] Returning information for job: 20180125081438729573
2018-01-25 08:14:38,923 [salt.minion      ][INFO    ][5280] Starting a new job with PID 5280
2018-01-25 08:14:38,971 [salt.minion      ][INFO    ][5280] Returning information for job: 20180125081438815757
2018-01-25 08:34:09,883 [salt.utils.schedule][INFO    ][27383] Running scheduled job: __mine_interval
2018-01-25 09:25:07,171 [salt.minion      ][INFO    ][27383] User sudo_ubuntu Executing command cp.push_dir with jid 20180125092507159772
2018-01-25 09:25:08,222 [salt.minion      ][INFO    ][10382] Starting a new job with PID 10382
