2019-09-15 03:44:22,781 [salt.utils.decorators:613 ][WARNING ][2010] The function "module.run" is using its deprecated version and will expire in version "Sodium".
2019-09-15 03:44:25,836 [salt.loaded.int.module.cmdmod:395 ][INFO    ][3083] Executing command ['systemctl', 'status', 'salt-minion.service', '-n', '0'] in directory '/root'
2019-09-15 03:44:25,859 [salt.loaded.int.module.cmdmod:395 ][INFO    ][3083] Executing command ['systemd-run', '--scope', 'systemctl', 'restart', 'salt-minion.service'] in directory '/root'
2019-09-15 03:44:25,891 [salt.utils.parsers:1051][WARNING ][1659] Minion received a SIGTERM. Exiting.
2019-09-15 03:44:26,680 [salt.cli.daemons :293 ][INFO    ][3138] Setting up the Salt Minion "odl01.mcp-odl-ha.local"
2019-09-15 03:44:26,758 [salt.cli.daemons :82  ][INFO    ][3138] Starting up the Salt Minion
2019-09-15 03:44:26,759 [salt.utils.event :1017][INFO    ][3138] Starting pull socket on /var/run/salt/minion/minion_event_7b9c575c4c_pull.ipc
2019-09-15 03:44:27,202 [salt.minion      :976 ][INFO    ][3138] Creating minion process manager
2019-09-15 03:44:28,161 [salt.loader.192.168.11.2.int.module.cmdmod:395 ][INFO    ][3138] Executing command ['date', '+%z'] in directory '/root'
2019-09-15 03:44:28,178 [salt.utils.schedule:568 ][INFO    ][3138] Updating job settings for scheduled job: __mine_interval
2019-09-15 03:44:28,202 [salt.minion      :1108][INFO    ][3138] Added mine.update to scheduler
2019-09-15 03:44:28,343 [salt.minion      :1975][INFO    ][3138] Minion is starting as user 'root'
2019-09-15 03:44:28,355 [salt.minion      :2336][INFO    ][3138] Minion is ready to receive requests!
2019-09-15 03:45:33,626 [salt.minion      :1308][INFO    ][3138] User sudo_ubuntu Executing command state.apply with jid 20190915034533616266
2019-09-15 03:45:33,637 [salt.minion      :1432][INFO    ][3237] Starting a new job with PID 3237
2019-09-15 03:45:37,505 [salt.state       :915 ][INFO    ][3237] Loading fresh modules for state activity
2019-09-15 03:45:37,637 [salt.fileclient  :1219][INFO    ][3237] Fetching file from saltenv 'base', ** done ** 'linux/init.sls'
2019-09-15 03:45:37,726 [salt.fileclient  :1219][INFO    ][3237] Fetching file from saltenv 'base', ** done ** 'linux/system/init.sls'
2019-09-15 03:45:37,824 [salt.fileclient  :1219][INFO    ][3237] Fetching file from saltenv 'base', ** done ** 'linux/system/env.sls'
2019-09-15 03:45:38,501 [salt.fileclient  :1219][INFO    ][3237] Fetching file from saltenv 'base', ** done ** 'linux/system/profile.sls'
2019-09-15 03:45:38,588 [salt.fileclient  :1219][INFO    ][3237] Fetching file from saltenv 'base', ** done ** 'linux/system/shell.sls'
2019-09-15 03:45:38,690 [salt.fileclient  :1219][INFO    ][3237] Fetching file from saltenv 'base', ** done ** 'linux/system/login_defs.sls'
2019-09-15 03:45:38,763 [salt.fileclient  :1219][INFO    ][3237] Fetching file from saltenv 'base', ** done ** 'linux/system/at.sls'
2019-09-15 03:45:38,842 [salt.fileclient  :1219][INFO    ][3237] Fetching file from saltenv 'base', ** done ** 'linux/system/cron.sls'
2019-09-15 03:45:38,927 [salt.fileclient  :1219][INFO    ][3237] Fetching file from saltenv 'base', ** done ** 'linux/system/package.sls'
2019-09-15 03:45:39,009 [salt.fileclient  :1219][INFO    ][3237] Fetching file from saltenv 'base', ** done ** 'linux/system/timezone.sls'
2019-09-15 03:45:39,083 [salt.fileclient  :1219][INFO    ][3237] Fetching file from saltenv 'base', ** done ** 'linux/system/kernel.sls'
2019-09-15 03:45:39,208 [salt.fileclient  :1219][INFO    ][3237] Fetching file from saltenv 'base', ** done ** 'linux/system/grub.sls'
2019-09-15 03:45:39,228 [salt.fileclient  :1219][INFO    ][3237] Fetching file from saltenv 'base', ** done ** 'linux/system/cpu.sls'
2019-09-15 03:45:39,303 [salt.fileclient  :1219][INFO    ][3237] Fetching file from saltenv 'base', ** done ** 'linux/system/sysfs.sls'
2019-09-15 03:45:39,381 [salt.fileclient  :1219][INFO    ][3237] Fetching file from saltenv 'base', ** done ** 'linux/system/locale.sls'
2019-09-15 03:45:39,455 [salt.fileclient  :1219][INFO    ][3237] Fetching file from saltenv 'base', ** done ** 'linux/system/user.sls'
2019-09-15 03:45:39,547 [salt.fileclient  :1219][INFO    ][3237] Fetching file from saltenv 'base', ** done ** 'linux/system/group.sls'
2019-09-15 03:45:39,625 [salt.fileclient  :1219][INFO    ][3237] Fetching file from saltenv 'base', ** done ** 'linux/system/limit.sls'
2019-09-15 03:45:39,707 [salt.fileclient  :1219][INFO    ][3237] Fetching file from saltenv 'base', ** done ** 'linux/system/service.sls'
2019-09-15 03:45:39,778 [salt.fileclient  :1219][INFO    ][3237] Fetching file from saltenv 'base', ** done ** 'linux/system/systemd.sls'
2019-09-15 03:45:39,852 [salt.fileclient  :1219][INFO    ][3237] Fetching file from saltenv 'base', ** done ** 'linux/system/file.sls'
2019-09-15 03:45:39,937 [salt.fileclient  :1219][INFO    ][3237] Fetching file from saltenv 'base', ** done ** 'linux/system/apt.sls'
2019-09-15 03:45:40,042 [salt.fileclient  :1219][INFO    ][3237] Fetching file from saltenv 'base', ** done ** 'linux/system/banner.sls'
2019-09-15 03:45:40,562 [salt.fileclient  :1219][INFO    ][3237] Fetching file from saltenv 'base', ** done ** 'linux/network/init.sls'
2019-09-15 03:45:40,638 [salt.fileclient  :1219][INFO    ][3237] Fetching file from saltenv 'base', ** done ** 'linux/network/hostname.sls'
2019-09-15 03:45:40,712 [salt.fileclient  :1219][INFO    ][3237] Fetching file from saltenv 'base', ** done ** 'linux/network/host.sls'
2019-09-15 03:45:40,830 [salt.fileclient  :1219][INFO    ][3237] Fetching file from saltenv 'base', ** done ** 'linux/network/interface.sls'
2019-09-15 03:45:40,980 [salt.fileclient  :1219][INFO    ][3237] Fetching file from saltenv 'base', ** done ** 'linux/network/proxy.sls'
2019-09-15 03:45:41,058 [salt.fileclient  :1219][INFO    ][3237] Fetching file from saltenv 'base', ** done ** 'linux/storage/init.sls'
2019-09-15 03:45:41,133 [salt.fileclient  :1219][INFO    ][3237] Fetching file from saltenv 'base', ** done ** 'linux/storage/mount.sls'
2019-09-15 03:45:41,218 [salt.fileclient  :1219][INFO    ][3237] Fetching file from saltenv 'base', ** done ** 'ntp/init.sls'
2019-09-15 03:45:41,233 [salt.fileclient  :1219][INFO    ][3237] Fetching file from saltenv 'base', ** done ** 'ntp/client.sls'
2019-09-15 03:45:41,262 [salt.fileclient  :1219][INFO    ][3237] Fetching file from saltenv 'base', ** done ** 'ntp/server.sls'
2019-09-15 03:45:41,291 [salt.state       :1780][INFO    ][3237] Running state [/etc/environment] at time 03:45:41.290976
2019-09-15 03:45:41,291 [salt.state       :1813][INFO    ][3237] Executing state file.blockreplace for [/etc/environment]
2019-09-15 03:45:41,296 [salt.state       :300 ][INFO    ][3237] 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

2019-09-15 03:45:41,296 [salt.state       :1951][INFO    ][3237] Completed state [/etc/environment] at time 03:45:41.296897 duration_in_ms=5.921
2019-09-15 03:45:41,297 [salt.state       :1780][INFO    ][3237] Running state [/etc/profile.d] at time 03:45:41.297072
2019-09-15 03:45:41,297 [salt.state       :1813][INFO    ][3237] Executing state file.directory for [/etc/profile.d]
2019-09-15 03:45:41,307 [salt.state       :300 ][INFO    ][3237] Directory /etc/profile.d is in the correct state
Directory /etc/profile.d updated
2019-09-15 03:45:41,308 [salt.state       :1951][INFO    ][3237] Completed state [/etc/profile.d] at time 03:45:41.307994 duration_in_ms=10.922
2019-09-15 03:45:41,308 [salt.state       :1780][INFO    ][3237] Running state [/etc/bash.bashrc] at time 03:45:41.308160
2019-09-15 03:45:41,308 [salt.state       :1813][INFO    ][3237] Executing state file.blockreplace for [/etc/bash.bashrc]
2019-09-15 03:45:42,559 [salt.loaded.int.module.cmdmod:395 ][INFO    ][3237] Executing command ['git', '--version'] in directory '/root'
2019-09-15 03:45:42,896 [salt.loaded.int.module.cmdmod:395 ][INFO    ][3237] Executing command 'test -f /etc/bash.bashrc' in directory '/root'
2019-09-15 03:45:42,945 [salt.state       :300 ][INFO    ][3237] File changed:
--- 
+++ 
@@ -66,3 +66,6 @@
 		fi
 	}
 fi
+# BEGIN CIS 5.4.4 default user umask
+umask 027
+# END CIS 5.4.4 default user umask

2019-09-15 03:45:42,945 [salt.state       :1951][INFO    ][3237] Completed state [/etc/bash.bashrc] at time 03:45:42.945383 duration_in_ms=1637.222
2019-09-15 03:45:42,945 [salt.state       :1780][INFO    ][3237] Running state [/etc/profile] at time 03:45:42.945643
2019-09-15 03:45:42,945 [salt.state       :1813][INFO    ][3237] Executing state file.blockreplace for [/etc/profile]
2019-09-15 03:45:42,949 [salt.loaded.int.module.cmdmod:395 ][INFO    ][3237] Executing command 'test -f /etc/profile' in directory '/root'
2019-09-15 03:45:42,969 [salt.state       :300 ][INFO    ][3237] File changed:
--- 
+++ 
@@ -25,3 +25,6 @@
   done
   unset i
 fi
+# BEGIN CIS 5.4.4 default user umask
+umask 027
+# END CIS 5.4.4 default user umask

2019-09-15 03:45:42,970 [salt.state       :1951][INFO    ][3237] Completed state [/etc/profile] at time 03:45:42.970035 duration_in_ms=24.391
2019-09-15 03:45:42,970 [salt.state       :1780][INFO    ][3237] Running state [/etc/login.defs] at time 03:45:42.970289
2019-09-15 03:45:42,970 [salt.state       :1813][INFO    ][3237] Executing state file.managed for [/etc/login.defs]
2019-09-15 03:45:42,990 [salt.fileclient  :1219][INFO    ][3237] Fetching file from saltenv 'base', ** done ** 'linux/files/login.defs.jinja'
2019-09-15 03:45:43,116 [salt.state       :300 ][INFO    ][3237] File changed:
--- 
+++ 
@@ -1,341 +1,28 @@
-#
-# /etc/login.defs - Configuration control definitions for the login package.
-#
-# Three items must be defined:  MAIL_DIR, ENV_SUPATH, and ENV_PATH.
-# If unspecified, some arbitrary (and possibly incorrect) value will
-# be assumed.  All other items are optional - if not specified then
-# the described action or option will be inhibited.
-#
-# Comment lines (lines beginning with "#") and blank lines are ignored.
-#
-# Modified for Linux.  --marekm
-
-# REQUIRED for useradd/userdel/usermod
-#   Directory where mailboxes reside, _or_ name of file, relative to the
-#   home directory.  If you _do_ define MAIL_DIR and MAIL_FILE,
-#   MAIL_DIR takes precedence.
-#
-#   Essentially:
-#      - MAIL_DIR defines the location of users mail spool files
-#        (for mbox use) by appending the username to MAIL_DIR as defined
-#        below.
-#      - MAIL_FILE defines the location of the users mail spool files as the
-#        fully-qualified filename obtained by prepending the user home
-#        directory before $MAIL_FILE
-#
-# NOTE: This is no more used for setting up users MAIL environment variable
-#       which is, starting from shadow 4.0.12-1 in Debian, entirely the
-#       job of the pam_mail PAM modules
-#       See default PAM configuration files provided for
-#       login, su, etc.
-#
-# This is a temporary situation: setting these variables will soon
-# move to /etc/default/useradd and the variables will then be
-# no more supported
-MAIL_DIR        /var/mail
-#MAIL_FILE      .mail
-
-#
-# Enable logging and display of /var/log/faillog login failure info.
-# This option conflicts with the pam_tally PAM module.
-#
-FAILLOG_ENAB		yes
-
-#
-# Enable display of unknown usernames when login failures are recorded.
-#
-# WARNING: Unknown usernames may become world readable. 
-# See #290803 and #298773 for details about how this could become a security
-# concern
-LOG_UNKFAIL_ENAB	no
-
-#
-# Enable logging of successful logins
-#
-LOG_OK_LOGINS		no
-
-#
-# Enable "syslog" logging of su activity - in addition to sulog file logging.
-# SYSLOG_SG_ENAB does the same for newgrp and sg.
-#
-SYSLOG_SU_ENAB		yes
-SYSLOG_SG_ENAB		yes
-
-#
-# If defined, all su activity is logged to this file.
-#
-#SULOG_FILE	/var/log/sulog
-
-#
-# If defined, file which maps tty line to TERM environment parameter.
-# Each line of the file is in a format something like "vt100  tty01".
-#
-#TTYTYPE_FILE	/etc/ttytype
-
-#
-# If defined, login failures will be logged here in a utmp format
-# last, when invoked as lastb, will read /var/log/btmp, so...
-#
-FTMP_FILE	/var/log/btmp
-
-#
-# If defined, the command name to display when running "su -".  For
-# example, if this is defined as "su" then a "ps" will display the
-# command is "-su".  If not defined, then "ps" would display the
-# name of the shell actually being run, e.g. something like "-sh".
-#
-SU_NAME		su
-
-#
-# If defined, file which inhibits all the usual chatter during the login
-# sequence.  If a full pathname, then hushed mode will be enabled if the
-# user's name or shell are found in the file.  If not a full pathname, then
-# hushed mode will be enabled if the file exists in the user's home directory.
-#
-HUSHLOGIN_FILE	.hushlogin
-#HUSHLOGIN_FILE	/etc/hushlogins
-
-#
-# *REQUIRED*  The default PATH settings, for superuser and normal users.
-#
-# (they are minimal, add the rest in the shell startup files)
-ENV_SUPATH	PATH=/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin
-ENV_PATH	PATH=/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games
-
-#
-# Terminal permissions
-#
-#	TTYGROUP	Login tty will be assigned this group ownership.
-#	TTYPERM		Login tty will be set to this permission.
-#
-# If you have a "write" program which is "setgid" to a special group
-# which owns the terminals, define TTYGROUP to the group number and
-# TTYPERM to 0620.  Otherwise leave TTYGROUP commented out and assign
-# TTYPERM to either 622 or 600.
-#
-# In Debian /usr/bin/bsd-write or similar programs are setgid tty
-# However, the default and recommended value for TTYPERM is still 0600
-# to not allow anyone to write to anyone else console or terminal
-
-# Users can still allow other people to write them by issuing 
-# the "mesg y" command.
-
-TTYGROUP	tty
-TTYPERM		0600
-
-#
-# Login configuration initializations:
-#
-#	ERASECHAR	Terminal ERASE character ('\010' = backspace).
-#	KILLCHAR	Terminal KILL character ('\025' = CTRL/U).
-#	UMASK		Default "umask" value.
-#
-# The ERASECHAR and KILLCHAR are used only on System V machines.
-# 
-# UMASK is the default umask value for pam_umask and is used by
-# useradd and newusers to set the mode of the new home directories.
-# 022 is the "historical" value in Debian for UMASK
-# 027, or even 077, could be considered better for privacy
-# There is no One True Answer here : each sysadmin must make up his/her
-# mind.
-#
-# If USERGROUPS_ENAB is set to "yes", that will modify this UMASK default value
-# for private user groups, i. e. the uid is the same as gid, and username is
-# the same as the primary group name: for these, the user permissions will be
-# used as group permissions, e. g. 022 will become 002.
-#
-# Prefix these values with "0" to get octal, "0x" to get hexadecimal.
-#
-ERASECHAR	0177
-KILLCHAR	025
-UMASK		022
-
-#
-# Password aging controls:
-#
-#	PASS_MAX_DAYS	Maximum number of days a password may be used.
-#	PASS_MIN_DAYS	Minimum number of days allowed between password changes.
-#	PASS_WARN_AGE	Number of days warning given before a password expires.
-#
-PASS_MAX_DAYS	99999
-PASS_MIN_DAYS	0
-PASS_WARN_AGE	7
-
-#
-# Min/max values for automatic uid selection in useradd
-#
-UID_MIN			 1000
-UID_MAX			60000
-# System accounts
-#SYS_UID_MIN		  100
-#SYS_UID_MAX		  999
-
-#
-# Min/max values for automatic gid selection in groupadd
-#
-GID_MIN			 1000
-GID_MAX			60000
-# System accounts
-#SYS_GID_MIN		  100
-#SYS_GID_MAX		  999
-
-#
-# Max number of login retries if password is bad. This will most likely be
-# overriden by PAM, since the default pam_unix module has it's own built
-# in of 3 retries. However, this is a safe fallback in case you are using
-# an authentication module that does not enforce PAM_MAXTRIES.
-#
-LOGIN_RETRIES		5
-
-#
-# Max time in seconds for login
-#
-LOGIN_TIMEOUT		60
-
-#
-# Which fields may be changed by regular users using chfn - use
-# any combination of letters "frwh" (full name, room number, work
-# phone, home phone).  If not defined, no changes are allowed.
-# For backward compatibility, "yes" = "rwh" and "no" = "frwh".
-# 
-CHFN_RESTRICT		rwh
-
-#
-# Should login be allowed if we can't cd to the home directory?
-# Default in no.
-#
-DEFAULT_HOME	yes
-
-#
-# If defined, this command is run when removing a user.
-# It should remove any at/cron/print jobs etc. owned by
-# the user to be removed (passed as the first argument).
-#
-#USERDEL_CMD	/usr/sbin/userdel_local
-
-#
-# Enable setting of the umask group bits to be the same as owner bits
-# (examples: 022 -> 002, 077 -> 007) for non-root users, if the uid is
-# the same as gid, and username is the same as the primary group name.
-#
-# If set to yes, userdel will remove the user´s group if it contains no
-# more members, and useradd will create by default a group with the name
-# of the user.
-#
-USERGROUPS_ENAB yes
-
-#
-# Instead of the real user shell, the program specified by this parameter
-# will be launched, although its visible name (argv[0]) will be the shell's.
-# The program may do whatever it wants (logging, additional authentification,
-# banner, ...) before running the actual shell.
-#
-# FAKE_SHELL /bin/fakeshell
-
-#
-# If defined, either full pathname of a file containing device names or
-# a ":" delimited list of device names.  Root logins will be allowed only
-# upon these devices.
-#
-# This variable is used by login and su.
-#
-#CONSOLE	/etc/consoles
-#CONSOLE	console:tty01:tty02:tty03:tty04
-
-#
-# List of groups to add to the user's supplementary group set
-# when logging in on the console (as determined by the CONSOLE
-# setting).  Default is none.
-#
-# Use with caution - it is possible for users to gain permanent
-# access to these groups, even when not logged in on the console.
-# How to do it is left as an exercise for the reader...
-#
-# This variable is used by login and su.
-#
-#CONSOLE_GROUPS		floppy:audio:cdrom
-
-#
-# If set to "yes", new passwords will be encrypted using the MD5-based
-# algorithm compatible with the one used by recent releases of FreeBSD.
-# It supports passwords of unlimited length and longer salt strings.
-# Set to "no" if you need to copy encrypted passwords to other systems
-# which don't understand the new algorithm.  Default is "no".
-#
-# This variable is deprecated. You should use ENCRYPT_METHOD.
-#
-#MD5_CRYPT_ENAB	no
-
-#
-# If set to MD5 , MD5-based algorithm will be used for encrypting password
-# If set to SHA256, SHA256-based algorithm will be used for encrypting password
-# If set to SHA512, SHA512-based algorithm will be used for encrypting password
-# If set to DES, DES-based algorithm will be used for encrypting password (default)
-# Overrides the MD5_CRYPT_ENAB option
-#
-# Note: It is recommended to use a value consistent with
-# the PAM modules configuration.
-#
-ENCRYPT_METHOD SHA512
-
-#
-# Only used if ENCRYPT_METHOD is set to SHA256 or SHA512.
-#
-# Define the number of SHA rounds.
-# With a lot of rounds, it is more difficult to brute forcing the password.
-# But note also that it more CPU resources will be needed to authenticate
-# users.
-#
-# If not specified, the libc will choose the default number of rounds (5000).
-# The values must be inside the 1000-999999999 range.
-# If only one of the MIN or MAX values is set, then this value will be used.
-# If MIN > MAX, the highest value will be used.
-#
-# SHA_CRYPT_MIN_ROUNDS 5000
-# SHA_CRYPT_MAX_ROUNDS 5000
-
-################# OBSOLETED BY PAM ##############
-#						#
-# These options are now handled by PAM. Please	#
-# edit the appropriate file in /etc/pam.d/ to	#
-# enable the equivelants of them.
-#
-###############
-
-#MOTD_FILE
-#DIALUPS_CHECK_ENAB
-#LASTLOG_ENAB
-#MAIL_CHECK_ENAB
-#OBSCURE_CHECKS_ENAB
-#PORTTIME_CHECKS_ENAB
-#SU_WHEEL_ONLY
-#CRACKLIB_DICTPATH
-#PASS_CHANGE_TRIES
-#PASS_ALWAYS_WARN
-#ENVIRON_FILE
-#NOLOGINS_FILE
-#ISSUE_FILE
-#PASS_MIN_LEN
-#PASS_MAX_LEN
-#ULIMIT
-#ENV_HZ
-#CHFN_AUTH
-#CHSH_AUTH
-#FAIL_DELAY
-
-################# OBSOLETED #######################
-#						  #
-# These options are no more handled by shadow.    #
-#                                                 #
-# Shadow utilities will display a warning if they #
-# still appear.                                   #
-#                                                 #
-###################################################
-
-# CLOSE_SESSIONS
-# LOGIN_STRING
-# NO_PASSWORD_CONSOLE
-# QMAIL_DIR
-
-
-
+# This file is managed by Salt, do not edit
+CHFN_RESTRICT        rwh
+DEFAULT_HOME         yes
+ENCRYPT_METHOD       SHA512
+ENV_PATH             PATH=/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games
+ENV_SUPATH           PATH=/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin
+ERASECHAR            0177
+GID_MAX              60000
+GID_MIN              1000
+HUSHLOGIN_FILE       .hushlogin
+KILLCHAR             025
+LOG_OK_LOGINS        no
+LOG_UNKFAIL_ENAB     no
+LOGIN_RETRIES        5
+LOGIN_TIMEOUT        60
+MAIL_DIR             /var/mail
+PASS_MAX_DAYS        90
+PASS_MIN_DAYS        7
+PASS_WARN_AGE        7
+SU_NAME              su
+SYSLOG_SG_ENAB       yes
+SYSLOG_SU_ENAB       yes
+TTYGROUP             tty
+TTYPERM              0600
+UID_MAX              60000
+UID_MIN              1000
+UMASK                022
+USERGROUPS_ENAB      yes

2019-09-15 03:45:43,131 [salt.state       :1951][INFO    ][3237] Completed state [/etc/login.defs] at time 03:45:43.131265 duration_in_ms=160.975
2019-09-15 03:45:43,136 [salt.state       :1780][INFO    ][3237] Running state [at] at time 03:45:43.136794
2019-09-15 03:45:43,137 [salt.state       :1813][INFO    ][3237] Executing state pkg.installed for [at]
2019-09-15 03:45:43,137 [salt.loaded.int.module.cmdmod:395 ][INFO    ][3237] Executing command ['dpkg-query', '--showformat', '${Status} ${Package} ${Version} ${Architecture}', '-W'] in directory '/root'
2019-09-15 03:45:43,427 [salt.state       :300 ][INFO    ][3237] All specified packages are already installed
2019-09-15 03:45:43,427 [salt.state       :1951][INFO    ][3237] Completed state [at] at time 03:45:43.427762 duration_in_ms=290.968
2019-09-15 03:45:43,429 [salt.state       :1780][INFO    ][3237] Running state [atd] at time 03:45:43.429273
2019-09-15 03:45:43,429 [salt.state       :1813][INFO    ][3237] Executing state service.running for [atd]
2019-09-15 03:45:43,430 [salt.loaded.int.module.cmdmod:395 ][INFO    ][3237] Executing command ['systemctl', 'status', 'atd.service', '-n', '0'] in directory '/root'
2019-09-15 03:45:43,451 [salt.loaded.int.module.cmdmod:395 ][INFO    ][3237] Executing command ['systemctl', 'is-active', 'atd.service'] in directory '/root'
2019-09-15 03:45:43,461 [salt.loaded.int.module.cmdmod:395 ][INFO    ][3237] Executing command ['systemctl', 'is-enabled', 'atd.service'] in directory '/root'
2019-09-15 03:45:43,471 [salt.state       :300 ][INFO    ][3237] The service atd is already running
2019-09-15 03:45:43,472 [salt.state       :1951][INFO    ][3237] Completed state [atd] at time 03:45:43.472210 duration_in_ms=42.938
2019-09-15 03:45:43,473 [salt.state       :1780][INFO    ][3237] Running state [cron] at time 03:45:43.473958
2019-09-15 03:45:43,474 [salt.state       :1813][INFO    ][3237] Executing state pkg.installed for [cron]
2019-09-15 03:45:43,480 [salt.state       :300 ][INFO    ][3237] All specified packages are already installed
2019-09-15 03:45:43,480 [salt.state       :1951][INFO    ][3237] Completed state [cron] at time 03:45:43.480439 duration_in_ms=6.481
2019-09-15 03:45:43,481 [salt.state       :1780][INFO    ][3237] Running state [/etc/at.allow] at time 03:45:43.481031
2019-09-15 03:45:43,481 [salt.state       :1813][INFO    ][3237] Executing state file.managed for [/etc/at.allow]
2019-09-15 03:45:43,496 [salt.fileclient  :1219][INFO    ][3237] Fetching file from saltenv 'base', ** done ** 'linux/files/cron_users.jinja'
2019-09-15 03:45:43,503 [salt.state       :300 ][INFO    ][3237] File changed:
New file
2019-09-15 03:45:43,503 [salt.state       :1951][INFO    ][3237] Completed state [/etc/at.allow] at time 03:45:43.503357 duration_in_ms=22.325
2019-09-15 03:45:43,503 [salt.state       :1780][INFO    ][3237] Running state [/etc/at.deny] at time 03:45:43.503525
2019-09-15 03:45:43,503 [salt.state       :1813][INFO    ][3237] Executing state file.absent for [/etc/at.deny]
2019-09-15 03:45:43,504 [salt.state       :300 ][INFO    ][3237] {'removed': '/etc/at.deny'}
2019-09-15 03:45:43,504 [salt.state       :1951][INFO    ][3237] Completed state [/etc/at.deny] at time 03:45:43.504173 duration_in_ms=0.649
2019-09-15 03:45:43,504 [salt.state       :1780][INFO    ][3237] Running state [cron] at time 03:45:43.504890
2019-09-15 03:45:43,505 [salt.state       :1813][INFO    ][3237] Executing state service.running for [cron]
2019-09-15 03:45:43,505 [salt.loaded.int.module.cmdmod:395 ][INFO    ][3237] Executing command ['systemctl', 'status', 'cron.service', '-n', '0'] in directory '/root'
2019-09-15 03:45:43,517 [salt.loaded.int.module.cmdmod:395 ][INFO    ][3237] Executing command ['systemctl', 'is-active', 'cron.service'] in directory '/root'
2019-09-15 03:45:43,528 [salt.loaded.int.module.cmdmod:395 ][INFO    ][3237] Executing command ['systemctl', 'is-enabled', 'cron.service'] in directory '/root'
2019-09-15 03:45:43,538 [salt.state       :300 ][INFO    ][3237] The service cron is already running
2019-09-15 03:45:43,538 [salt.state       :1951][INFO    ][3237] Completed state [cron] at time 03:45:43.538915 duration_in_ms=34.024
2019-09-15 03:45:43,540 [salt.state       :1780][INFO    ][3237] Running state [/etc/cron.allow] at time 03:45:43.540164
2019-09-15 03:45:43,540 [salt.state       :1813][INFO    ][3237] Executing state file.managed for [/etc/cron.allow]
2019-09-15 03:45:43,558 [salt.state       :300 ][INFO    ][3237] File changed:
New file
2019-09-15 03:45:43,558 [salt.state       :1951][INFO    ][3237] Completed state [/etc/cron.allow] at time 03:45:43.558561 duration_in_ms=18.397
2019-09-15 03:45:43,558 [salt.state       :1780][INFO    ][3237] Running state [/etc/cron.deny] at time 03:45:43.558732
2019-09-15 03:45:43,558 [salt.state       :1813][INFO    ][3237] Executing state file.absent for [/etc/cron.deny]
2019-09-15 03:45:43,559 [salt.state       :300 ][INFO    ][3237] File /etc/cron.deny is not present
2019-09-15 03:45:43,559 [salt.state       :1951][INFO    ][3237] Completed state [/etc/cron.deny] at time 03:45:43.559330 duration_in_ms=0.598
2019-09-15 03:45:43,559 [salt.state       :1780][INFO    ][3237] Running state [/etc/crontab] at time 03:45:43.559940
2019-09-15 03:45:43,560 [salt.state       :1813][INFO    ][3237] Executing state file.managed for [/etc/crontab]
2019-09-15 03:45:43,560 [salt.state       :300 ][INFO    ][3237] {'mode': '0600'}
2019-09-15 03:45:43,560 [salt.state       :1951][INFO    ][3237] Completed state [/etc/crontab] at time 03:45:43.560896 duration_in_ms=0.955
2019-09-15 03:45:43,561 [salt.state       :1780][INFO    ][3237] Running state [/etc/cron.d] at time 03:45:43.561505
2019-09-15 03:45:43,561 [salt.state       :1813][INFO    ][3237] Executing state file.directory for [/etc/cron.d]
2019-09-15 03:45:43,562 [salt.state       :300 ][INFO    ][3237] {'mode': '0600'}
2019-09-15 03:45:43,562 [salt.state       :1951][INFO    ][3237] Completed state [/etc/cron.d] at time 03:45:43.562640 duration_in_ms=1.135
2019-09-15 03:45:43,563 [salt.state       :1780][INFO    ][3237] Running state [/etc/cron.daily] at time 03:45:43.563288
2019-09-15 03:45:43,563 [salt.state       :1813][INFO    ][3237] Executing state file.directory for [/etc/cron.daily]
2019-09-15 03:45:43,655 [salt.state       :300 ][INFO    ][3237] {'mode': '0600'}
2019-09-15 03:45:43,655 [salt.state       :1951][INFO    ][3237] Completed state [/etc/cron.daily] at time 03:45:43.655565 duration_in_ms=92.276
2019-09-15 03:45:43,656 [salt.state       :1780][INFO    ][3237] Running state [/etc/cron.hourly] at time 03:45:43.656288
2019-09-15 03:45:43,656 [salt.state       :1813][INFO    ][3237] Executing state file.directory for [/etc/cron.hourly]
2019-09-15 03:45:43,664 [salt.state       :300 ][INFO    ][3237] {'mode': '0600'}
2019-09-15 03:45:43,664 [salt.state       :1951][INFO    ][3237] Completed state [/etc/cron.hourly] at time 03:45:43.664354 duration_in_ms=8.066
2019-09-15 03:45:43,664 [salt.state       :1780][INFO    ][3237] Running state [/etc/cron.monthly] at time 03:45:43.664959
2019-09-15 03:45:43,665 [salt.state       :1813][INFO    ][3237] Executing state file.directory for [/etc/cron.monthly]
2019-09-15 03:45:43,665 [salt.state       :300 ][INFO    ][3237] {'mode': '0600'}
2019-09-15 03:45:43,666 [salt.state       :1951][INFO    ][3237] Completed state [/etc/cron.monthly] at time 03:45:43.666054 duration_in_ms=1.095
2019-09-15 03:45:43,666 [salt.state       :1780][INFO    ][3237] Running state [/etc/cron.weekly] at time 03:45:43.666661
2019-09-15 03:45:43,666 [salt.state       :1813][INFO    ][3237] Executing state file.directory for [/etc/cron.weekly]
2019-09-15 03:45:43,671 [salt.state       :300 ][INFO    ][3237] {'mode': '0600'}
2019-09-15 03:45:43,672 [salt.state       :1951][INFO    ][3237] Completed state [/etc/cron.weekly] at time 03:45:43.671978 duration_in_ms=5.316
2019-09-15 03:45:43,672 [salt.state       :1780][INFO    ][3237] Running state [linux_extra_packages_removed] at time 03:45:43.672152
2019-09-15 03:45:43,672 [salt.state       :1813][INFO    ][3237] Executing state pkg.removed for [linux_extra_packages_removed]
2019-09-15 03:45:43,687 [salt.loaded.int.module.cmdmod:395 ][INFO    ][3237] Executing command ['systemd-run', '--scope', 'apt-get', '-q', '-y', 'remove', 'telnet'] in directory '/root'
2019-09-15 03:45:48,691 [salt.minion      :1308][INFO    ][3138] User sudo_ubuntu Executing command saltutil.find_job with jid 20190915034548680473
2019-09-15 03:45:48,705 [salt.minion      :1432][INFO    ][3551] Starting a new job with PID 3551
2019-09-15 03:45:48,720 [salt.minion      :1711][INFO    ][3551] Returning information for job: 20190915034548680473
2019-09-15 03:45:48,984 [salt.loaded.int.module.cmdmod:395 ][INFO    ][3237] Executing command ['dpkg-query', '--showformat', '${Status} ${Package} ${Version} ${Architecture}', '-W'] in directory '/root'
2019-09-15 03:45:49,012 [salt.state       :300 ][INFO    ][3237] Made the following changes:
'telnet-client' changed from '1' to 'absent'
'telnet' changed from '0.17-40' to 'absent'

2019-09-15 03:45:49,031 [salt.state       :915 ][INFO    ][3237] Loading fresh modules for state activity
2019-09-15 03:45:49,055 [salt.state       :1951][INFO    ][3237] Completed state [linux_extra_packages_removed] at time 03:45:49.055787 duration_in_ms=5383.633
2019-09-15 03:45:49,062 [salt.state       :1780][INFO    ][3237] Running state [linux_extra_packages_latest] at time 03:45:49.062192
2019-09-15 03:45:49,062 [salt.state       :1813][INFO    ][3237] Executing state pkg.latest for [linux_extra_packages_latest]
2019-09-15 03:45:49,587 [salt.loaded.int.module.cmdmod:395 ][INFO    ][3237] Executing command ['apt-get', '-q', 'update'] in directory '/root'
2019-09-15 03:45:51,361 [salt.loaded.int.module.cmdmod:395 ][INFO    ][3237] Executing command ['apt-cache', '-q', 'policy', 'python-tornado'] in directory '/root'
2019-09-15 03:45:51,400 [salt.loaded.int.module.cmdmod:395 ][INFO    ][3237] Executing command ['apt-cache', '-q', 'policy', 'smartmontools'] in directory '/root'
2019-09-15 03:45:51,444 [salt.loaded.int.module.cmdmod:395 ][INFO    ][3237] Executing command ['dpkg', '--get-selections', '*'] in directory '/root'
2019-09-15 03:45:51,463 [salt.loaded.int.module.cmdmod:395 ][INFO    ][3237] Executing command ['systemd-run', '--scope', 'apt-get', '-q', '-y', '-o', 'DPkg::Options::=--force-confold', '-o', 'DPkg::Options::=--force-confdef', 'install', 'smartmontools'] in directory '/root'
2019-09-15 03:46:09,240 [salt.loaded.int.module.cmdmod:395 ][INFO    ][3237] Executing command ['dpkg-query', '--showformat', '${Status} ${Package} ${Version} ${Architecture}', '-W'] in directory '/root'
2019-09-15 03:46:09,267 [salt.state       :300 ][INFO    ][3237] Made the following changes:
'mail-reader' changed from 'absent' to '1'
'smartmontools' changed from 'absent' to '6.4+svn4214-1'
'mailx' changed from 'absent' to '1'
'imap-client' changed from 'absent' to '1'
's-nail' changed from 'absent' to '14.8.6-1'

2019-09-15 03:46:09,282 [salt.state       :915 ][INFO    ][3237] Loading fresh modules for state activity
2019-09-15 03:46:09,304 [salt.state       :1951][INFO    ][3237] Completed state [linux_extra_packages_latest] at time 03:46:09.304601 duration_in_ms=20242.409
2019-09-15 03:46:09,309 [salt.state       :1780][INFO    ][3237] Running state [UTC] at time 03:46:09.309284
2019-09-15 03:46:09,309 [salt.state       :1813][INFO    ][3237] Executing state timezone.system for [UTC]
2019-09-15 03:46:09,313 [salt.loaded.int.module.cmdmod:395 ][INFO    ][3237] Executing command ['timedatectl'] in directory '/root'
2019-09-15 03:46:09,587 [salt.state       :300 ][INFO    ][3237] Timezone UTC already set, UTC already set to UTC
2019-09-15 03:46:09,588 [salt.state       :1951][INFO    ][3237] Completed state [UTC] at time 03:46:09.588042 duration_in_ms=278.759
2019-09-15 03:46:09,591 [salt.state       :1780][INFO    ][3237] Running state [/etc/default/grub.d] at time 03:46:09.591262
2019-09-15 03:46:09,591 [salt.state       :1813][INFO    ][3237] Executing state file.directory for [/etc/default/grub.d]
2019-09-15 03:46:09,595 [salt.state       :300 ][INFO    ][3237] Directory /etc/default/grub.d is in the correct state
Directory /etc/default/grub.d updated
2019-09-15 03:46:09,603 [salt.state       :1951][INFO    ][3237] Completed state [/etc/default/grub.d] at time 03:46:09.602994 duration_in_ms=11.732
2019-09-15 03:46:09,603 [salt.state       :1780][INFO    ][3237] Running state [update-grub] at time 03:46:09.603764
2019-09-15 03:46:09,604 [salt.state       :1813][INFO    ][3237] Executing state cmd.wait for [update-grub]
2019-09-15 03:46:09,604 [salt.state       :300 ][INFO    ][3237] No changes made for update-grub
2019-09-15 03:46:09,604 [salt.state       :1951][INFO    ][3237] Completed state [update-grub] at time 03:46:09.604876 duration_in_ms=1.112
2019-09-15 03:46:09,606 [salt.state       :1780][INFO    ][3237] Running state [/boot/grub/grub.cfg] at time 03:46:09.606363
2019-09-15 03:46:09,606 [salt.state       :1813][INFO    ][3237] Executing state file.managed for [/boot/grub/grub.cfg]
2019-09-15 03:46:10,299 [salt.loaded.int.module.cmdmod:395 ][INFO    ][3237] Executing command 'test -f /boot/grub/grub.cfg' in directory '/root'
2019-09-15 03:46:10,310 [salt.loaded.int.states.file:2298][WARNING ][3237] State for file: /boot/grub/grub.cfg - 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.
2019-09-15 03:46:10,311 [salt.state       :300 ][INFO    ][3237] {'mode': '0400'}
2019-09-15 03:46:10,311 [salt.state       :1951][INFO    ][3237] Completed state [/boot/grub/grub.cfg] at time 03:46:10.311578 duration_in_ms=705.215
2019-09-15 03:46:10,311 [salt.state       :1780][INFO    ][3237] Running state [nf_conntrack] at time 03:46:10.311849
2019-09-15 03:46:10,312 [salt.state       :1813][INFO    ][3237] Executing state kmod.present for [nf_conntrack]
2019-09-15 03:46:10,312 [salt.loaded.int.module.cmdmod:395 ][INFO    ][3237] Executing command 'lsmod' in directory '/root'
2019-09-15 03:46:11,650 [salt.loaded.int.module.cmdmod:395 ][INFO    ][3237] Executing command 'lsmod' in directory '/root'
2019-09-15 03:46:11,665 [salt.loaded.int.module.cmdmod:395 ][INFO    ][3237] Executing command 'modprobe nf_conntrack' in directory '/root'
2019-09-15 03:46:11,745 [salt.loaded.int.module.cmdmod:395 ][INFO    ][3237] Executing command 'lsmod' in directory '/root'
2019-09-15 03:46:11,816 [salt.state       :300 ][INFO    ][3237] {'nf_conntrack': 'loaded'}
2019-09-15 03:46:11,816 [salt.state       :1951][INFO    ][3237] Completed state [nf_conntrack] at time 03:46:11.816562 duration_in_ms=1504.712
2019-09-15 03:46:11,816 [salt.state       :1780][INFO    ][3237] Running state [/etc/modprobe.d] at time 03:46:11.816868
2019-09-15 03:46:11,817 [salt.state       :1813][INFO    ][3237] Executing state file.directory for [/etc/modprobe.d]
2019-09-15 03:46:11,817 [salt.state       :300 ][INFO    ][3237] Directory /etc/modprobe.d is in the correct state
Directory /etc/modprobe.d updated
2019-09-15 03:46:11,818 [salt.state       :1951][INFO    ][3237] Completed state [/etc/modprobe.d] at time 03:46:11.818066 duration_in_ms=1.198
2019-09-15 03:46:11,819 [salt.state       :1780][INFO    ][3237] Running state [/etc/modprobe.d/hfsplus.conf] at time 03:46:11.819561
2019-09-15 03:46:11,819 [salt.state       :1813][INFO    ][3237] Executing state file.managed for [/etc/modprobe.d/hfsplus.conf]
2019-09-15 03:46:11,835 [salt.fileclient  :1219][INFO    ][3237] Fetching file from saltenv 'base', ** done ** 'linux/files/modprobe.conf.jinja'
2019-09-15 03:46:12,003 [salt.state       :300 ][INFO    ][3237] File changed:
New file
2019-09-15 03:46:12,004 [salt.state       :1951][INFO    ][3237] Completed state [/etc/modprobe.d/hfsplus.conf] at time 03:46:12.004102 duration_in_ms=184.54
2019-09-15 03:46:12,005 [salt.state       :1780][INFO    ][3237] Running state [/etc/modprobe.d/rds.conf] at time 03:46:12.004983
2019-09-15 03:46:12,005 [salt.state       :1813][INFO    ][3237] Executing state file.managed for [/etc/modprobe.d/rds.conf]
2019-09-15 03:46:12,107 [salt.state       :300 ][INFO    ][3237] File changed:
New file
2019-09-15 03:46:12,107 [salt.state       :1951][INFO    ][3237] Completed state [/etc/modprobe.d/rds.conf] at time 03:46:12.107808 duration_in_ms=102.825
2019-09-15 03:46:12,108 [salt.state       :1780][INFO    ][3237] Running state [/etc/modprobe.d/cramfs.conf] at time 03:46:12.108644
2019-09-15 03:46:12,108 [salt.state       :1813][INFO    ][3237] Executing state file.managed for [/etc/modprobe.d/cramfs.conf]
2019-09-15 03:46:12,191 [salt.state       :300 ][INFO    ][3237] File changed:
New file
2019-09-15 03:46:12,192 [salt.state       :1951][INFO    ][3237] Completed state [/etc/modprobe.d/cramfs.conf] at time 03:46:12.192038 duration_in_ms=83.394
2019-09-15 03:46:12,192 [salt.state       :1780][INFO    ][3237] Running state [/etc/modprobe.d/freevxfs.conf] at time 03:46:12.192772
2019-09-15 03:46:12,192 [salt.state       :1813][INFO    ][3237] Executing state file.managed for [/etc/modprobe.d/freevxfs.conf]
2019-09-15 03:46:12,278 [salt.state       :300 ][INFO    ][3237] File changed:
New file
2019-09-15 03:46:12,278 [salt.state       :1951][INFO    ][3237] Completed state [/etc/modprobe.d/freevxfs.conf] at time 03:46:12.278162 duration_in_ms=85.39
2019-09-15 03:46:12,279 [salt.state       :1780][INFO    ][3237] Running state [/etc/modprobe.d/hfs.conf] at time 03:46:12.278997
2019-09-15 03:46:12,279 [salt.state       :1813][INFO    ][3237] Executing state file.managed for [/etc/modprobe.d/hfs.conf]
2019-09-15 03:46:12,364 [salt.state       :300 ][INFO    ][3237] File changed:
New file
2019-09-15 03:46:12,364 [salt.state       :1951][INFO    ][3237] Completed state [/etc/modprobe.d/hfs.conf] at time 03:46:12.364162 duration_in_ms=85.165
2019-09-15 03:46:12,365 [salt.state       :1780][INFO    ][3237] Running state [/etc/modprobe.d/squashfs.conf] at time 03:46:12.364974
2019-09-15 03:46:12,365 [salt.state       :1813][INFO    ][3237] Executing state file.managed for [/etc/modprobe.d/squashfs.conf]
2019-09-15 03:46:12,450 [salt.state       :300 ][INFO    ][3237] File changed:
New file
2019-09-15 03:46:12,450 [salt.state       :1951][INFO    ][3237] Completed state [/etc/modprobe.d/squashfs.conf] at time 03:46:12.450477 duration_in_ms=85.502
2019-09-15 03:46:12,451 [salt.state       :1780][INFO    ][3237] Running state [/etc/modprobe.d/udf.conf] at time 03:46:12.451351
2019-09-15 03:46:12,451 [salt.state       :1813][INFO    ][3237] Executing state file.managed for [/etc/modprobe.d/udf.conf]
2019-09-15 03:46:12,543 [salt.state       :300 ][INFO    ][3237] File changed:
New file
2019-09-15 03:46:12,544 [salt.state       :1951][INFO    ][3237] Completed state [/etc/modprobe.d/udf.conf] at time 03:46:12.544138 duration_in_ms=92.786
2019-09-15 03:46:12,545 [salt.state       :1780][INFO    ][3237] Running state [/etc/modprobe.d/vfat.conf] at time 03:46:12.545001
2019-09-15 03:46:12,545 [salt.state       :1813][INFO    ][3237] Executing state file.managed for [/etc/modprobe.d/vfat.conf]
2019-09-15 03:46:12,630 [salt.state       :300 ][INFO    ][3237] File changed:
New file
2019-09-15 03:46:12,630 [salt.state       :1951][INFO    ][3237] Completed state [/etc/modprobe.d/vfat.conf] at time 03:46:12.630300 duration_in_ms=85.299
2019-09-15 03:46:12,631 [salt.state       :1780][INFO    ][3237] Running state [/etc/modprobe.d/sctp.conf] at time 03:46:12.631088
2019-09-15 03:46:12,631 [salt.state       :1813][INFO    ][3237] Executing state file.managed for [/etc/modprobe.d/sctp.conf]
2019-09-15 03:46:12,713 [salt.state       :300 ][INFO    ][3237] File changed:
New file
2019-09-15 03:46:12,713 [salt.state       :1951][INFO    ][3237] Completed state [/etc/modprobe.d/sctp.conf] at time 03:46:12.713285 duration_in_ms=82.196
2019-09-15 03:46:12,714 [salt.state       :1780][INFO    ][3237] Running state [/etc/modprobe.d/jffs2.conf] at time 03:46:12.714062
2019-09-15 03:46:12,714 [salt.state       :1813][INFO    ][3237] Executing state file.managed for [/etc/modprobe.d/jffs2.conf]
2019-09-15 03:46:12,797 [salt.state       :300 ][INFO    ][3237] File changed:
New file
2019-09-15 03:46:12,797 [salt.state       :1951][INFO    ][3237] Completed state [/etc/modprobe.d/jffs2.conf] at time 03:46:12.797909 duration_in_ms=83.847
2019-09-15 03:46:12,798 [salt.state       :1780][INFO    ][3237] Running state [/etc/modprobe.d/tipc.conf] at time 03:46:12.798682
2019-09-15 03:46:12,798 [salt.state       :1813][INFO    ][3237] Executing state file.managed for [/etc/modprobe.d/tipc.conf]
2019-09-15 03:46:12,880 [salt.state       :300 ][INFO    ][3237] File changed:
New file
2019-09-15 03:46:12,880 [salt.state       :1951][INFO    ][3237] Completed state [/etc/modprobe.d/tipc.conf] at time 03:46:12.880175 duration_in_ms=81.493
2019-09-15 03:46:12,880 [salt.state       :1780][INFO    ][3237] Running state [/etc/modprobe.d/dccp.conf] at time 03:46:12.880921
2019-09-15 03:46:12,881 [salt.state       :1813][INFO    ][3237] Executing state file.managed for [/etc/modprobe.d/dccp.conf]
2019-09-15 03:46:12,964 [salt.state       :300 ][INFO    ][3237] File changed:
New file
2019-09-15 03:46:12,964 [salt.state       :1951][INFO    ][3237] Completed state [/etc/modprobe.d/dccp.conf] at time 03:46:12.964340 duration_in_ms=83.418
2019-09-15 03:46:12,964 [salt.state       :1780][INFO    ][3237] Running state [net.ipv4.tcp_congestion_control] at time 03:46:12.964509
2019-09-15 03:46:12,964 [salt.state       :1813][INFO    ][3237] Executing state sysctl.present for [net.ipv4.tcp_congestion_control]
2019-09-15 03:46:12,965 [salt.loaded.int.module.cmdmod:395 ][INFO    ][3237] Executing command 'sysctl -w net.ipv4.tcp_congestion_control="yeah"' in directory '/root'
2019-09-15 03:46:13,353 [salt.state       :300 ][INFO    ][3237] {'net.ipv4.tcp_congestion_control': 'yeah'}
2019-09-15 03:46:13,355 [salt.state       :1951][INFO    ][3237] Completed state [net.ipv4.tcp_congestion_control] at time 03:46:13.355297 duration_in_ms=390.787
2019-09-15 03:46:13,355 [salt.state       :1780][INFO    ][3237] Running state [net.core.netdev_budget] at time 03:46:13.355702
2019-09-15 03:46:13,356 [salt.state       :1813][INFO    ][3237] Executing state sysctl.present for [net.core.netdev_budget]
2019-09-15 03:46:13,357 [salt.loaded.int.module.cmdmod:395 ][INFO    ][3237] Executing command 'sysctl -w net.core.netdev_budget="600"' in directory '/root'
2019-09-15 03:46:13,371 [salt.state       :300 ][INFO    ][3237] {'net.core.netdev_budget': 600}
2019-09-15 03:46:13,371 [salt.state       :1951][INFO    ][3237] Completed state [net.core.netdev_budget] at time 03:46:13.371626 duration_in_ms=15.924
2019-09-15 03:46:13,372 [salt.state       :1780][INFO    ][3237] Running state [net.ipv4.tcp_slow_start_after_idle] at time 03:46:13.371970
2019-09-15 03:46:13,372 [salt.state       :1813][INFO    ][3237] Executing state sysctl.present for [net.ipv4.tcp_slow_start_after_idle]
2019-09-15 03:46:13,516 [salt.loaded.int.module.cmdmod:395 ][INFO    ][3237] Executing command 'sysctl -w net.ipv4.tcp_slow_start_after_idle="0"' in directory '/root'
2019-09-15 03:46:13,530 [salt.state       :300 ][INFO    ][3237] {'net.ipv4.tcp_slow_start_after_idle': 0}
2019-09-15 03:46:13,531 [salt.state       :1951][INFO    ][3237] Completed state [net.ipv4.tcp_slow_start_after_idle] at time 03:46:13.530926 duration_in_ms=158.956
2019-09-15 03:46:13,531 [salt.state       :1780][INFO    ][3237] Running state [net.ipv4.icmp_echo_ignore_broadcasts] at time 03:46:13.531294
2019-09-15 03:46:13,531 [salt.state       :1813][INFO    ][3237] Executing state sysctl.present for [net.ipv4.icmp_echo_ignore_broadcasts]
2019-09-15 03:46:13,635 [salt.loaded.int.module.cmdmod:395 ][INFO    ][3237] Executing command 'sysctl -w net.ipv4.icmp_echo_ignore_broadcasts="1"' in directory '/root'
2019-09-15 03:46:13,856 [salt.state       :300 ][INFO    ][3237] {'net.ipv4.icmp_echo_ignore_broadcasts': 1}
2019-09-15 03:46:13,857 [salt.state       :1951][INFO    ][3237] Completed state [net.ipv4.icmp_echo_ignore_broadcasts] at time 03:46:13.857138 duration_in_ms=325.843
2019-09-15 03:46:13,857 [salt.state       :1780][INFO    ][3237] Running state [net.nf_conntrack_max] at time 03:46:13.857612
2019-09-15 03:46:13,858 [salt.state       :1813][INFO    ][3237] Executing state sysctl.present for [net.nf_conntrack_max]
2019-09-15 03:46:13,859 [salt.loaded.int.module.cmdmod:395 ][INFO    ][3237] Executing command 'sysctl -w net.nf_conntrack_max="1048576"' in directory '/root'
2019-09-15 03:46:13,872 [salt.state       :300 ][INFO    ][3237] {'net.nf_conntrack_max': 1048576}
2019-09-15 03:46:13,873 [salt.state       :1951][INFO    ][3237] Completed state [net.nf_conntrack_max] at time 03:46:13.873269 duration_in_ms=15.656
2019-09-15 03:46:13,873 [salt.state       :1780][INFO    ][3237] Running state [net.ipv4.icmp_ignore_bogus_error_responses] at time 03:46:13.873691
2019-09-15 03:46:13,874 [salt.state       :1813][INFO    ][3237] Executing state sysctl.present for [net.ipv4.icmp_ignore_bogus_error_responses]
2019-09-15 03:46:14,251 [salt.loaded.int.module.cmdmod:395 ][INFO    ][3237] Executing command 'sysctl -w net.ipv4.icmp_ignore_bogus_error_responses="1"' in directory '/root'
2019-09-15 03:46:14,265 [salt.state       :300 ][INFO    ][3237] {'net.ipv4.icmp_ignore_bogus_error_responses': 1}
2019-09-15 03:46:14,265 [salt.state       :1951][INFO    ][3237] Completed state [net.ipv4.icmp_ignore_bogus_error_responses] at time 03:46:14.265771 duration_in_ms=392.08
2019-09-15 03:46:14,266 [salt.state       :1780][INFO    ][3237] Running state [net.ipv4.conf.default.log_martians] at time 03:46:14.266158
2019-09-15 03:46:14,266 [salt.state       :1813][INFO    ][3237] Executing state sysctl.present for [net.ipv4.conf.default.log_martians]
2019-09-15 03:46:14,587 [salt.loaded.int.module.cmdmod:395 ][INFO    ][3237] Executing command 'sysctl -w net.ipv4.conf.default.log_martians="1"' in directory '/root'
2019-09-15 03:46:14,600 [salt.state       :300 ][INFO    ][3237] {'net.ipv4.conf.default.log_martians': 1}
2019-09-15 03:46:14,600 [salt.state       :1951][INFO    ][3237] Completed state [net.ipv4.conf.default.log_martians] at time 03:46:14.600615 duration_in_ms=334.456
2019-09-15 03:46:14,600 [salt.state       :1780][INFO    ][3237] Running state [net.core.somaxconn] at time 03:46:14.600959
2019-09-15 03:46:14,601 [salt.state       :1813][INFO    ][3237] Executing state sysctl.present for [net.core.somaxconn]
2019-09-15 03:46:14,602 [salt.loaded.int.module.cmdmod:395 ][INFO    ][3237] Executing command 'sysctl -w net.core.somaxconn="4096"' in directory '/root'
2019-09-15 03:46:14,613 [salt.state       :300 ][INFO    ][3237] {'net.core.somaxconn': 4096}
2019-09-15 03:46:14,613 [salt.state       :1951][INFO    ][3237] Completed state [net.core.somaxconn] at time 03:46:14.613304 duration_in_ms=12.344
2019-09-15 03:46:14,613 [salt.state       :1780][INFO    ][3237] Running state [net.ipv4.conf.all.send_redirects] at time 03:46:14.613618
2019-09-15 03:46:14,613 [salt.state       :1813][INFO    ][3237] Executing state sysctl.present for [net.ipv4.conf.all.send_redirects]
2019-09-15 03:46:14,647 [salt.loaded.int.module.cmdmod:395 ][INFO    ][3237] Executing command 'sysctl -w net.ipv4.conf.all.send_redirects="0"' in directory '/root'
2019-09-15 03:46:14,658 [salt.state       :300 ][INFO    ][3237] {'net.ipv4.conf.all.send_redirects': 0}
2019-09-15 03:46:14,659 [salt.state       :1951][INFO    ][3237] Completed state [net.ipv4.conf.all.send_redirects] at time 03:46:14.659046 duration_in_ms=45.428
2019-09-15 03:46:14,659 [salt.state       :1780][INFO    ][3237] Running state [net.ipv4.tcp_tw_reuse] at time 03:46:14.659386
2019-09-15 03:46:14,659 [salt.state       :1813][INFO    ][3237] Executing state sysctl.present for [net.ipv4.tcp_tw_reuse]
2019-09-15 03:46:14,827 [salt.loaded.int.module.cmdmod:395 ][INFO    ][3237] Executing command 'sysctl -w net.ipv4.tcp_tw_reuse="1"' in directory '/root'
2019-09-15 03:46:14,840 [salt.state       :300 ][INFO    ][3237] {'net.ipv4.tcp_tw_reuse': 1}
2019-09-15 03:46:14,841 [salt.state       :1951][INFO    ][3237] Completed state [net.ipv4.tcp_tw_reuse] at time 03:46:14.841258 duration_in_ms=181.871
2019-09-15 03:46:14,841 [salt.state       :1780][INFO    ][3237] Running state [net.ipv4.conf.default.rp_filter] at time 03:46:14.841623
2019-09-15 03:46:14,841 [salt.state       :1813][INFO    ][3237] Executing state sysctl.present for [net.ipv4.conf.default.rp_filter]
2019-09-15 03:46:14,842 [salt.loaded.int.module.cmdmod:395 ][INFO    ][3237] Executing command 'sysctl -w net.ipv4.conf.default.rp_filter="1"' in directory '/root'
2019-09-15 03:46:14,855 [salt.state       :300 ][INFO    ][3237] {'net.ipv4.conf.default.rp_filter': 1}
2019-09-15 03:46:14,855 [salt.state       :1951][INFO    ][3237] Completed state [net.ipv4.conf.default.rp_filter] at time 03:46:14.855369 duration_in_ms=13.746
2019-09-15 03:46:14,855 [salt.state       :1780][INFO    ][3237] Running state [net.ipv4.tcp_fin_timeout] at time 03:46:14.855725
2019-09-15 03:46:14,856 [salt.state       :1813][INFO    ][3237] Executing state sysctl.present for [net.ipv4.tcp_fin_timeout]
2019-09-15 03:46:14,863 [salt.loaded.int.module.cmdmod:395 ][INFO    ][3237] Executing command 'sysctl -w net.ipv4.tcp_fin_timeout="30"' in directory '/root'
2019-09-15 03:46:14,875 [salt.state       :300 ][INFO    ][3237] {'net.ipv4.tcp_fin_timeout': 30}
2019-09-15 03:46:14,875 [salt.state       :1951][INFO    ][3237] Completed state [net.ipv4.tcp_fin_timeout] at time 03:46:14.875571 duration_in_ms=19.846
2019-09-15 03:46:14,875 [salt.state       :1780][INFO    ][3237] Running state [net.core.netdev_budget_usecs] at time 03:46:14.875921
2019-09-15 03:46:14,876 [salt.state       :1813][INFO    ][3237] Executing state sysctl.present for [net.core.netdev_budget_usecs]
2019-09-15 03:46:14,877 [salt.loaded.int.module.cmdmod:395 ][INFO    ][3237] Executing command 'sysctl -w net.core.netdev_budget_usecs="5000"' in directory '/root'
2019-09-15 03:46:14,889 [salt.state       :300 ][INFO    ][3237] {'net.core.netdev_budget_usecs': 5000}
2019-09-15 03:46:14,889 [salt.state       :1951][INFO    ][3237] Completed state [net.core.netdev_budget_usecs] at time 03:46:14.889791 duration_in_ms=13.869
2019-09-15 03:46:14,890 [salt.state       :1780][INFO    ][3237] Running state [kernel.panic] at time 03:46:14.890145
2019-09-15 03:46:14,890 [salt.state       :1813][INFO    ][3237] Executing state sysctl.present for [kernel.panic]
2019-09-15 03:46:14,911 [salt.loaded.int.module.cmdmod:395 ][INFO    ][3237] Executing command 'sysctl -w kernel.panic="60"' in directory '/root'
2019-09-15 03:46:14,923 [salt.state       :300 ][INFO    ][3237] {'kernel.panic': 60}
2019-09-15 03:46:14,923 [salt.state       :1951][INFO    ][3237] Completed state [kernel.panic] at time 03:46:14.923447 duration_in_ms=33.302
2019-09-15 03:46:14,923 [salt.state       :1780][INFO    ][3237] Running state [net.ipv4.tcp_keepalive_probes] at time 03:46:14.923798
2019-09-15 03:46:14,924 [salt.state       :1813][INFO    ][3237] Executing state sysctl.present for [net.ipv4.tcp_keepalive_probes]
2019-09-15 03:46:15,078 [salt.loaded.int.module.cmdmod:395 ][INFO    ][3237] Executing command 'sysctl -w net.ipv4.tcp_keepalive_probes="8"' in directory '/root'
2019-09-15 03:46:15,091 [salt.state       :300 ][INFO    ][3237] {'net.ipv4.tcp_keepalive_probes': 8}
2019-09-15 03:46:15,092 [salt.state       :1951][INFO    ][3237] Completed state [net.ipv4.tcp_keepalive_probes] at time 03:46:15.092323 duration_in_ms=168.525
2019-09-15 03:46:15,092 [salt.state       :1780][INFO    ][3237] Running state [net.ipv4.conf.all.log_martians] at time 03:46:15.092690
2019-09-15 03:46:15,093 [salt.state       :1813][INFO    ][3237] Executing state sysctl.present for [net.ipv4.conf.all.log_martians]
2019-09-15 03:46:15,156 [salt.loaded.int.module.cmdmod:395 ][INFO    ][3237] Executing command 'sysctl -w net.ipv4.conf.all.log_martians="1"' in directory '/root'
2019-09-15 03:46:15,169 [salt.state       :300 ][INFO    ][3237] {'net.ipv4.conf.all.log_martians': 1}
2019-09-15 03:46:15,170 [salt.state       :1951][INFO    ][3237] Completed state [net.ipv4.conf.all.log_martians] at time 03:46:15.169995 duration_in_ms=77.305
2019-09-15 03:46:15,170 [salt.state       :1780][INFO    ][3237] Running state [fs.suid_dumpable] at time 03:46:15.170359
2019-09-15 03:46:15,170 [salt.state       :1813][INFO    ][3237] Executing state sysctl.present for [fs.suid_dumpable]
2019-09-15 03:46:15,171 [salt.loaded.int.module.cmdmod:395 ][INFO    ][3237] Executing command 'sysctl -w fs.suid_dumpable="0"' in directory '/root'
2019-09-15 03:46:15,184 [salt.state       :300 ][INFO    ][3237] {'fs.suid_dumpable': 0}
2019-09-15 03:46:15,184 [salt.state       :1951][INFO    ][3237] Completed state [fs.suid_dumpable] at time 03:46:15.184442 duration_in_ms=14.083
2019-09-15 03:46:15,184 [salt.state       :1780][INFO    ][3237] Running state [net.ipv4.conf.default.accept_redirects] at time 03:46:15.184810
2019-09-15 03:46:15,185 [salt.state       :1813][INFO    ][3237] Executing state sysctl.present for [net.ipv4.conf.default.accept_redirects]
2019-09-15 03:46:15,228 [salt.loaded.int.module.cmdmod:395 ][INFO    ][3237] Executing command 'sysctl -w net.ipv4.conf.default.accept_redirects="0"' in directory '/root'
2019-09-15 03:46:15,241 [salt.state       :300 ][INFO    ][3237] {'net.ipv4.conf.default.accept_redirects': 0}
2019-09-15 03:46:15,241 [salt.state       :1951][INFO    ][3237] Completed state [net.ipv4.conf.default.accept_redirects] at time 03:46:15.241877 duration_in_ms=57.067
2019-09-15 03:46:15,242 [salt.state       :1780][INFO    ][3237] Running state [net.ipv4.conf.default.secure_redirects] at time 03:46:15.242258
2019-09-15 03:46:15,242 [salt.state       :1813][INFO    ][3237] Executing state sysctl.present for [net.ipv4.conf.default.secure_redirects]
2019-09-15 03:46:15,243 [salt.loaded.int.module.cmdmod:395 ][INFO    ][3237] Executing command 'sysctl -w net.ipv4.conf.default.secure_redirects="0"' in directory '/root'
2019-09-15 03:46:15,256 [salt.state       :300 ][INFO    ][3237] {'net.ipv4.conf.default.secure_redirects': 0}
2019-09-15 03:46:15,256 [salt.state       :1951][INFO    ][3237] Completed state [net.ipv4.conf.default.secure_redirects] at time 03:46:15.256558 duration_in_ms=14.3
2019-09-15 03:46:15,256 [salt.state       :1780][INFO    ][3237] Running state [net.ipv4.conf.default.accept_source_route] at time 03:46:15.256937
2019-09-15 03:46:15,257 [salt.state       :1813][INFO    ][3237] Executing state sysctl.present for [net.ipv4.conf.default.accept_source_route]
2019-09-15 03:46:15,295 [salt.loaded.int.module.cmdmod:395 ][INFO    ][3237] Executing command 'sysctl -w net.ipv4.conf.default.accept_source_route="0"' in directory '/root'
2019-09-15 03:46:15,307 [salt.state       :300 ][INFO    ][3237] {'net.ipv4.conf.default.accept_source_route': 0}
2019-09-15 03:46:15,308 [salt.state       :1951][INFO    ][3237] Completed state [net.ipv4.conf.default.accept_source_route] at time 03:46:15.308206 duration_in_ms=51.269
2019-09-15 03:46:15,308 [salt.state       :1780][INFO    ][3237] Running state [net.ipv4.tcp_keepalive_intvl] at time 03:46:15.308585
2019-09-15 03:46:15,308 [salt.state       :1813][INFO    ][3237] Executing state sysctl.present for [net.ipv4.tcp_keepalive_intvl]
2019-09-15 03:46:15,309 [salt.loaded.int.module.cmdmod:395 ][INFO    ][3237] Executing command 'sysctl -w net.ipv4.tcp_keepalive_intvl="3"' in directory '/root'
2019-09-15 03:46:15,322 [salt.state       :300 ][INFO    ][3237] {'net.ipv4.tcp_keepalive_intvl': 3}
2019-09-15 03:46:15,322 [salt.state       :1951][INFO    ][3237] Completed state [net.ipv4.tcp_keepalive_intvl] at time 03:46:15.322494 duration_in_ms=13.909
2019-09-15 03:46:15,322 [salt.state       :1780][INFO    ][3237] Running state [net.ipv4.tcp_keepalive_time] at time 03:46:15.322822
2019-09-15 03:46:15,323 [salt.state       :1813][INFO    ][3237] Executing state sysctl.present for [net.ipv4.tcp_keepalive_time]
2019-09-15 03:46:15,426 [salt.loaded.int.module.cmdmod:395 ][INFO    ][3237] Executing command 'sysctl -w net.ipv4.tcp_keepalive_time="30"' in directory '/root'
2019-09-15 03:46:15,440 [salt.state       :300 ][INFO    ][3237] {'net.ipv4.tcp_keepalive_time': 30}
2019-09-15 03:46:15,440 [salt.state       :1951][INFO    ][3237] Completed state [net.ipv4.tcp_keepalive_time] at time 03:46:15.440542 duration_in_ms=117.719
2019-09-15 03:46:15,440 [salt.state       :1780][INFO    ][3237] Running state [kernel.randomize_va_space] at time 03:46:15.440892
2019-09-15 03:46:15,441 [salt.state       :1813][INFO    ][3237] Executing state sysctl.present for [kernel.randomize_va_space]
2019-09-15 03:46:15,442 [salt.loaded.int.module.cmdmod:395 ][INFO    ][3237] Executing command 'sysctl -w kernel.randomize_va_space="2"' in directory '/root'
2019-09-15 03:46:15,455 [salt.state       :300 ][INFO    ][3237] {'kernel.randomize_va_space': 2}
2019-09-15 03:46:15,455 [salt.state       :1951][INFO    ][3237] Completed state [kernel.randomize_va_space] at time 03:46:15.455523 duration_in_ms=14.631
2019-09-15 03:46:15,455 [salt.state       :1780][INFO    ][3237] Running state [fs.file-max] at time 03:46:15.455828
2019-09-15 03:46:15,456 [salt.state       :1813][INFO    ][3237] Executing state sysctl.present for [fs.file-max]
2019-09-15 03:46:15,540 [salt.loaded.int.module.cmdmod:395 ][INFO    ][3237] Executing command 'sysctl -w fs.file-max="124165"' in directory '/root'
2019-09-15 03:46:15,553 [salt.state       :300 ][INFO    ][3237] {'fs.file-max': 124165}
2019-09-15 03:46:15,554 [salt.state       :1951][INFO    ][3237] Completed state [fs.file-max] at time 03:46:15.553962 duration_in_ms=98.134
2019-09-15 03:46:15,554 [salt.state       :1780][INFO    ][3237] Running state [net.ipv4.tcp_syncookies] at time 03:46:15.554351
2019-09-15 03:46:15,554 [salt.state       :1813][INFO    ][3237] Executing state sysctl.present for [net.ipv4.tcp_syncookies]
2019-09-15 03:46:15,606 [salt.loaded.int.module.cmdmod:395 ][INFO    ][3237] Executing command 'sysctl -w net.ipv4.tcp_syncookies="1"' in directory '/root'
2019-09-15 03:46:15,618 [salt.state       :300 ][INFO    ][3237] {'net.ipv4.tcp_syncookies': 1}
2019-09-15 03:46:15,619 [salt.state       :1951][INFO    ][3237] Completed state [net.ipv4.tcp_syncookies] at time 03:46:15.619221 duration_in_ms=64.87
2019-09-15 03:46:15,619 [salt.state       :1780][INFO    ][3237] Running state [net.ipv4.tcp_max_syn_backlog] at time 03:46:15.619581
2019-09-15 03:46:15,619 [salt.state       :1813][INFO    ][3237] Executing state sysctl.present for [net.ipv4.tcp_max_syn_backlog]
2019-09-15 03:46:15,620 [salt.loaded.int.module.cmdmod:395 ][INFO    ][3237] Executing command 'sysctl -w net.ipv4.tcp_max_syn_backlog="8192"' in directory '/root'
2019-09-15 03:46:15,632 [salt.state       :300 ][INFO    ][3237] {'net.ipv4.tcp_max_syn_backlog': 8192}
2019-09-15 03:46:15,632 [salt.state       :1951][INFO    ][3237] Completed state [net.ipv4.tcp_max_syn_backlog] at time 03:46:15.632467 duration_in_ms=12.885
2019-09-15 03:46:15,632 [salt.state       :1780][INFO    ][3237] Running state [net.ipv4.conf.all.rp_filter] at time 03:46:15.632835
2019-09-15 03:46:15,633 [salt.state       :1813][INFO    ][3237] Executing state sysctl.present for [net.ipv4.conf.all.rp_filter]
2019-09-15 03:46:15,642 [salt.loaded.int.module.cmdmod:395 ][INFO    ][3237] Executing command 'sysctl -w net.ipv4.conf.all.rp_filter="1"' in directory '/root'
2019-09-15 03:46:15,653 [salt.state       :300 ][INFO    ][3237] {'net.ipv4.conf.all.rp_filter': 1}
2019-09-15 03:46:15,653 [salt.state       :1951][INFO    ][3237] Completed state [net.ipv4.conf.all.rp_filter] at time 03:46:15.653542 duration_in_ms=20.707
2019-09-15 03:46:15,653 [salt.state       :1780][INFO    ][3237] Running state [net.ipv4.conf.all.accept_source_route] at time 03:46:15.653876
2019-09-15 03:46:15,654 [salt.state       :1813][INFO    ][3237] Executing state sysctl.present for [net.ipv4.conf.all.accept_source_route]
2019-09-15 03:46:15,666 [salt.loaded.int.module.cmdmod:395 ][INFO    ][3237] Executing command 'sysctl -w net.ipv4.conf.all.accept_source_route="0"' in directory '/root'
2019-09-15 03:46:15,677 [salt.state       :300 ][INFO    ][3237] {'net.ipv4.conf.all.accept_source_route': 0}
2019-09-15 03:46:15,677 [salt.state       :1951][INFO    ][3237] Completed state [net.ipv4.conf.all.accept_source_route] at time 03:46:15.677682 duration_in_ms=23.806
2019-09-15 03:46:15,678 [salt.state       :1780][INFO    ][3237] Running state [net.ipv4.tcp_retries2] at time 03:46:15.678051
2019-09-15 03:46:15,678 [salt.state       :1813][INFO    ][3237] Executing state sysctl.present for [net.ipv4.tcp_retries2]
2019-09-15 03:46:15,720 [salt.loaded.int.module.cmdmod:395 ][INFO    ][3237] Executing command 'sysctl -w net.ipv4.tcp_retries2="5"' in directory '/root'
2019-09-15 03:46:15,732 [salt.state       :300 ][INFO    ][3237] {'net.ipv4.tcp_retries2': 5}
2019-09-15 03:46:15,732 [salt.state       :1951][INFO    ][3237] Completed state [net.ipv4.tcp_retries2] at time 03:46:15.732615 duration_in_ms=54.563
2019-09-15 03:46:15,732 [salt.state       :1780][INFO    ][3237] Running state [net.core.netdev_max_backlog] at time 03:46:15.732957
2019-09-15 03:46:15,733 [salt.state       :1813][INFO    ][3237] Executing state sysctl.present for [net.core.netdev_max_backlog]
2019-09-15 03:46:15,780 [salt.loaded.int.module.cmdmod:395 ][INFO    ][3237] Executing command 'sysctl -w net.core.netdev_max_backlog="261144"' in directory '/root'
2019-09-15 03:46:15,792 [salt.state       :300 ][INFO    ][3237] {'net.core.netdev_max_backlog': 261144}
2019-09-15 03:46:15,793 [salt.state       :1951][INFO    ][3237] Completed state [net.core.netdev_max_backlog] at time 03:46:15.792998 duration_in_ms=60.04
2019-09-15 03:46:15,793 [salt.state       :1780][INFO    ][3237] Running state [vm.swappiness] at time 03:46:15.793303
2019-09-15 03:46:15,793 [salt.state       :1813][INFO    ][3237] Executing state sysctl.present for [vm.swappiness]
2019-09-15 03:46:15,794 [salt.loaded.int.module.cmdmod:395 ][INFO    ][3237] Executing command 'sysctl -w vm.swappiness="10"' in directory '/root'
2019-09-15 03:46:15,804 [salt.state       :300 ][INFO    ][3237] {'vm.swappiness': 10}
2019-09-15 03:46:15,804 [salt.state       :1951][INFO    ][3237] Completed state [vm.swappiness] at time 03:46:15.804917 duration_in_ms=11.614
2019-09-15 03:46:15,805 [salt.state       :1780][INFO    ][3237] Running state [net.ipv4.conf.all.secure_redirects] at time 03:46:15.805220
2019-09-15 03:46:15,805 [salt.state       :1813][INFO    ][3237] Executing state sysctl.present for [net.ipv4.conf.all.secure_redirects]
2019-09-15 03:46:15,821 [salt.loaded.int.module.cmdmod:395 ][INFO    ][3237] Executing command 'sysctl -w net.ipv4.conf.all.secure_redirects="0"' in directory '/root'
2019-09-15 03:46:15,833 [salt.state       :300 ][INFO    ][3237] {'net.ipv4.conf.all.secure_redirects': 0}
2019-09-15 03:46:15,833 [salt.state       :1951][INFO    ][3237] Completed state [net.ipv4.conf.all.secure_redirects] at time 03:46:15.833715 duration_in_ms=28.494
2019-09-15 03:46:15,834 [salt.state       :1780][INFO    ][3237] Running state [net.ipv4.neigh.default.gc_thresh1] at time 03:46:15.834026
2019-09-15 03:46:15,834 [salt.state       :1813][INFO    ][3237] Executing state sysctl.present for [net.ipv4.neigh.default.gc_thresh1]
2019-09-15 03:46:15,835 [salt.loaded.int.module.cmdmod:395 ][INFO    ][3237] Executing command 'sysctl -w net.ipv4.neigh.default.gc_thresh1="4096"' in directory '/root'
2019-09-15 03:46:15,845 [salt.state       :300 ][INFO    ][3237] {'net.ipv4.neigh.default.gc_thresh1': 4096}
2019-09-15 03:46:15,845 [salt.state       :1951][INFO    ][3237] Completed state [net.ipv4.neigh.default.gc_thresh1] at time 03:46:15.845607 duration_in_ms=11.581
2019-09-15 03:46:15,845 [salt.state       :1780][INFO    ][3237] Running state [net.ipv4.neigh.default.gc_thresh2] at time 03:46:15.845897
2019-09-15 03:46:15,846 [salt.state       :1813][INFO    ][3237] Executing state sysctl.present for [net.ipv4.neigh.default.gc_thresh2]
2019-09-15 03:46:15,847 [salt.loaded.int.module.cmdmod:395 ][INFO    ][3237] Executing command 'sysctl -w net.ipv4.neigh.default.gc_thresh2="8192"' in directory '/root'
2019-09-15 03:46:15,857 [salt.state       :300 ][INFO    ][3237] {'net.ipv4.neigh.default.gc_thresh2': 8192}
2019-09-15 03:46:15,858 [salt.state       :1951][INFO    ][3237] Completed state [net.ipv4.neigh.default.gc_thresh2] at time 03:46:15.857986 duration_in_ms=12.089
2019-09-15 03:46:15,858 [salt.state       :1780][INFO    ][3237] Running state [net.ipv4.neigh.default.gc_thresh3] at time 03:46:15.858292
2019-09-15 03:46:15,858 [salt.state       :1813][INFO    ][3237] Executing state sysctl.present for [net.ipv4.neigh.default.gc_thresh3]
2019-09-15 03:46:15,859 [salt.loaded.int.module.cmdmod:395 ][INFO    ][3237] Executing command 'sysctl -w net.ipv4.neigh.default.gc_thresh3="16384"' in directory '/root'
2019-09-15 03:46:15,869 [salt.state       :300 ][INFO    ][3237] {'net.ipv4.neigh.default.gc_thresh3': 16384}
2019-09-15 03:46:15,870 [salt.state       :1951][INFO    ][3237] Completed state [net.ipv4.neigh.default.gc_thresh3] at time 03:46:15.870261 duration_in_ms=11.969
2019-09-15 03:46:15,870 [salt.state       :1780][INFO    ][3237] Running state [net.ipv4.conf.default.send_redirects] at time 03:46:15.870560
2019-09-15 03:46:15,870 [salt.state       :1813][INFO    ][3237] Executing state sysctl.present for [net.ipv4.conf.default.send_redirects]
2019-09-15 03:46:15,871 [salt.loaded.int.module.cmdmod:395 ][INFO    ][3237] Executing command 'sysctl -w net.ipv4.conf.default.send_redirects="0"' in directory '/root'
2019-09-15 03:46:15,882 [salt.state       :300 ][INFO    ][3237] {'net.ipv4.conf.default.send_redirects': 0}
2019-09-15 03:46:15,883 [salt.state       :1951][INFO    ][3237] Completed state [net.ipv4.conf.default.send_redirects] at time 03:46:15.883002 duration_in_ms=12.441
2019-09-15 03:46:15,883 [salt.state       :1780][INFO    ][3237] Running state [net.ipv4.conf.all.accept_redirects] at time 03:46:15.883310
2019-09-15 03:46:15,883 [salt.state       :1813][INFO    ][3237] Executing state sysctl.present for [net.ipv4.conf.all.accept_redirects]
2019-09-15 03:46:15,929 [salt.loaded.int.module.cmdmod:395 ][INFO    ][3237] Executing command 'sysctl -w net.ipv4.conf.all.accept_redirects="0"' in directory '/root'
2019-09-15 03:46:15,941 [salt.state       :300 ][INFO    ][3237] {'net.ipv4.conf.all.accept_redirects': 0}
2019-09-15 03:46:15,941 [salt.state       :1951][INFO    ][3237] Completed state [net.ipv4.conf.all.accept_redirects] at time 03:46:15.941584 duration_in_ms=58.273
2019-09-15 03:46:15,941 [salt.state       :1780][INFO    ][3237] Running state [linux_sysfs_package] at time 03:46:15.941903
2019-09-15 03:46:15,942 [salt.state       :1813][INFO    ][3237] Executing state pkg.installed for [linux_sysfs_package]
2019-09-15 03:46:15,958 [salt.loaded.int.module.cmdmod:395 ][INFO    ][3237] Executing command ['apt-cache', '-q', 'policy', 'sysfsutils'] in directory '/root'
2019-09-15 03:46:16,002 [salt.loaded.int.module.cmdmod:395 ][INFO    ][3237] Executing command ['apt-get', '-q', 'update'] in directory '/root'
2019-09-15 03:46:17,896 [salt.loaded.int.module.cmdmod:395 ][INFO    ][3237] Executing command ['dpkg', '--get-selections', '*'] in directory '/root'
2019-09-15 03:46:17,915 [salt.loaded.int.module.cmdmod:395 ][INFO    ][3237] Executing command ['systemd-run', '--scope', 'apt-get', '-q', '-y', '-o', 'DPkg::Options::=--force-confold', '-o', 'DPkg::Options::=--force-confdef', 'install', 'sysfsutils'] in directory '/root'
2019-09-15 03:46:18,862 [salt.minion      :1308][INFO    ][3138] User sudo_ubuntu Executing command saltutil.find_job with jid 20190915034618852215
2019-09-15 03:46:18,876 [salt.minion      :1432][INFO    ][5027] Starting a new job with PID 5027
2019-09-15 03:46:18,896 [salt.minion      :1711][INFO    ][5027] Returning information for job: 20190915034618852215
2019-09-15 03:46:44,221 [salt.loaded.int.module.cmdmod:395 ][INFO    ][3237] Executing command ['dpkg-query', '--showformat', '${Status} ${Package} ${Version} ${Architecture}', '-W'] in directory '/root'
2019-09-15 03:46:44,258 [salt.state       :300 ][INFO    ][3237] Made the following changes:
'libsysfs2' changed from 'absent' to '2.1.0+repack-4'
'sysfsutils' changed from 'absent' to '2.1.0+repack-4'

2019-09-15 03:46:44,273 [salt.state       :915 ][INFO    ][3237] Loading fresh modules for state activity
2019-09-15 03:46:44,296 [salt.state       :1951][INFO    ][3237] Completed state [linux_sysfs_package] at time 03:46:44.296862 duration_in_ms=28354.958
2019-09-15 03:46:44,300 [salt.state       :1780][INFO    ][3237] Running state [/etc/sysfs.d] at time 03:46:44.300744
2019-09-15 03:46:44,301 [salt.state       :1813][INFO    ][3237] Executing state file.directory for [/etc/sysfs.d]
2019-09-15 03:46:44,303 [salt.state       :300 ][INFO    ][3237] Directory /etc/sysfs.d is in the correct state
Directory /etc/sysfs.d updated
2019-09-15 03:46:44,304 [salt.state       :1951][INFO    ][3237] Completed state [/etc/sysfs.d] at time 03:46:44.303986 duration_in_ms=3.242
2019-09-15 03:46:44,687 [salt.state       :1780][INFO    ][3237] Running state [ondemand] at time 03:46:44.687333
2019-09-15 03:46:44,687 [salt.state       :1813][INFO    ][3237] Executing state service.dead for [ondemand]
2019-09-15 03:46:44,688 [salt.loaded.int.module.cmdmod:395 ][INFO    ][3237] Executing command ['systemctl', 'status', 'ondemand.service', '-n', '0'] in directory '/root'
2019-09-15 03:46:44,702 [salt.loaded.int.module.cmdmod:395 ][INFO    ][3237] Executing command ['systemctl', 'is-active', 'ondemand.service'] in directory '/root'
2019-09-15 03:46:44,716 [salt.loaded.int.module.cmdmod:395 ][INFO    ][3237] Executing command ['systemctl', 'is-enabled', 'ondemand.service'] in directory '/root'
2019-09-15 03:46:44,732 [salt.loaded.int.module.cmdmod:395 ][INFO    ][3237] Executing command ['systemd-run', '--scope', 'systemctl', 'stop', 'ondemand.service'] in directory '/root'
2019-09-15 03:46:44,773 [salt.loaded.int.module.cmdmod:395 ][INFO    ][3237] Executing command ['systemctl', 'is-active', 'ondemand.service'] in directory '/root'
2019-09-15 03:46:44,785 [salt.loaded.int.module.cmdmod:395 ][INFO    ][3237] Executing command ['systemctl', 'is-enabled', 'ondemand.service'] in directory '/root'
2019-09-15 03:46:44,799 [salt.loaded.int.module.cmdmod:395 ][INFO    ][3237] Executing command ['systemctl', 'is-enabled', 'ondemand.service'] in directory '/root'
2019-09-15 03:46:44,817 [salt.loaded.int.module.cmdmod:395 ][INFO    ][3237] Executing command ['systemd-run', '--scope', '/usr/sbin/update-rc.d', '-f', 'ondemand', 'remove'] in directory '/root'
2019-09-15 03:46:44,963 [salt.loaded.int.module.cmdmod:395 ][INFO    ][3237] Executing command ['systemctl', 'is-enabled', 'ondemand.service'] in directory '/root'
2019-09-15 03:46:44,981 [salt.loaded.int.module.cmdmod:395 ][INFO    ][3237] Executing command 'runlevel' in directory '/root'
2019-09-15 03:46:44,994 [salt.state       :300 ][INFO    ][3237] {'ondemand': True}
2019-09-15 03:46:44,994 [salt.state       :1951][INFO    ][3237] Completed state [ondemand] at time 03:46:44.994433 duration_in_ms=307.1
2019-09-15 03:46:44,995 [salt.state       :1780][INFO    ][3237] Running state [en_US.UTF-8] at time 03:46:44.995537
2019-09-15 03:46:44,995 [salt.state       :1813][INFO    ][3237] Executing state locale.present for [en_US.UTF-8]
2019-09-15 03:46:44,996 [salt.loaded.int.module.cmdmod:395 ][INFO    ][3237] Executing command 'locale -a' in directory '/root'
2019-09-15 03:46:45,007 [salt.state       :300 ][INFO    ][3237] Locale en_US.UTF-8 is already present
2019-09-15 03:46:45,007 [salt.state       :1951][INFO    ][3237] Completed state [en_US.UTF-8] at time 03:46:45.007862 duration_in_ms=12.325
2019-09-15 03:46:45,009 [salt.state       :1780][INFO    ][3237] Running state [en_US.UTF-8] at time 03:46:45.009724
2019-09-15 03:46:45,010 [salt.state       :1813][INFO    ][3237] Executing state locale.system for [en_US.UTF-8]
2019-09-15 03:46:45,010 [salt.loaded.int.module.cmdmod:395 ][INFO    ][3237] Executing command 'localectl' in directory '/root'
2019-09-15 03:46:45,780 [salt.state       :300 ][INFO    ][3237] System locale en_US.UTF-8 already set
2019-09-15 03:46:45,780 [salt.state       :1951][INFO    ][3237] Completed state [en_US.UTF-8] at time 03:46:45.780668 duration_in_ms=770.942
2019-09-15 03:46:45,781 [salt.state       :1780][INFO    ][3237] Running state [root] at time 03:46:45.781792
2019-09-15 03:46:45,782 [salt.state       :1813][INFO    ][3237] Executing state group.present for [root]
2019-09-15 03:46:45,782 [salt.state       :300 ][INFO    ][3237] Group root is present and up to date
2019-09-15 03:46:45,782 [salt.state       :1951][INFO    ][3237] Completed state [root] at time 03:46:45.782694 duration_in_ms=0.902
2019-09-15 03:46:45,784 [salt.state       :1780][INFO    ][3237] Running state [root] at time 03:46:45.784722
2019-09-15 03:46:45,784 [salt.state       :1813][INFO    ][3237] Executing state user.present for [root]
2019-09-15 03:46:45,788 [salt.state       :300 ][INFO    ][3237] User root is present and up to date
2019-09-15 03:46:45,788 [salt.state       :1951][INFO    ][3237] Completed state [root] at time 03:46:45.788527 duration_in_ms=3.805
2019-09-15 03:46:45,789 [salt.state       :1780][INFO    ][3237] Running state [/root] at time 03:46:45.789422
2019-09-15 03:46:45,789 [salt.state       :1813][INFO    ][3237] Executing state file.directory for [/root]
2019-09-15 03:46:45,790 [salt.state       :300 ][INFO    ][3237] Directory /root is in the correct state
Directory /root updated
2019-09-15 03:46:45,790 [salt.state       :1951][INFO    ][3237] Completed state [/root] at time 03:46:45.790485 duration_in_ms=1.063
2019-09-15 03:46:45,790 [salt.state       :1780][INFO    ][3237] Running state [/etc/sudoers.d/90-salt-user-root] at time 03:46:45.790672
2019-09-15 03:46:45,790 [salt.state       :1813][INFO    ][3237] Executing state file.absent for [/etc/sudoers.d/90-salt-user-root]
2019-09-15 03:46:45,791 [salt.state       :300 ][INFO    ][3237] File /etc/sudoers.d/90-salt-user-root is not present
2019-09-15 03:46:45,791 [salt.state       :1951][INFO    ][3237] Completed state [/etc/sudoers.d/90-salt-user-root] at time 03:46:45.791335 duration_in_ms=0.664
2019-09-15 03:46:45,791 [salt.state       :1780][INFO    ][3237] Running state [ubuntu] at time 03:46:45.791518
2019-09-15 03:46:45,791 [salt.state       :1813][INFO    ][3237] Executing state group.present for [ubuntu]
2019-09-15 03:46:45,792 [salt.state       :300 ][INFO    ][3237] Group ubuntu is present and up to date
2019-09-15 03:46:45,792 [salt.state       :1951][INFO    ][3237] Completed state [ubuntu] at time 03:46:45.792147 duration_in_ms=0.63
2019-09-15 03:46:45,793 [salt.state       :1780][INFO    ][3237] Running state [ubuntu] at time 03:46:45.793272
2019-09-15 03:46:45,793 [salt.state       :1813][INFO    ][3237] Executing state user.present for [ubuntu]
2019-09-15 03:46:45,796 [salt.state       :300 ][INFO    ][3237] {'passwd': 'XXX-REDACTED-XXX'}
2019-09-15 03:46:45,796 [salt.state       :1951][INFO    ][3237] Completed state [ubuntu] at time 03:46:45.796267 duration_in_ms=2.995
2019-09-15 03:46:45,797 [salt.state       :1780][INFO    ][3237] Running state [/home/ubuntu] at time 03:46:45.797173
2019-09-15 03:46:45,797 [salt.state       :1813][INFO    ][3237] Executing state file.directory for [/home/ubuntu]
2019-09-15 03:46:45,798 [salt.state       :300 ][INFO    ][3237] {'mode': '0700'}
2019-09-15 03:46:45,798 [salt.state       :1951][INFO    ][3237] Completed state [/home/ubuntu] at time 03:46:45.798307 duration_in_ms=1.134
2019-09-15 03:46:45,799 [salt.state       :1780][INFO    ][3237] Running state [/etc/sudoers.d/90-salt-user-ubuntu] at time 03:46:45.799167
2019-09-15 03:46:45,799 [salt.state       :1813][INFO    ][3237] Executing state file.managed for [/etc/sudoers.d/90-salt-user-ubuntu]
2019-09-15 03:46:45,817 [salt.fileclient  :1219][INFO    ][3237] Fetching file from saltenv 'base', ** done ** 'linux/files/sudoer'
2019-09-15 03:46:45,840 [salt.loaded.int.module.cmdmod:395 ][INFO    ][3237] Executing command '/usr/sbin/visudo -c -f /tmp/__salt.tmp.ieIqqI' in directory '/root'
2019-09-15 03:46:45,918 [salt.state       :300 ][INFO    ][3237] File changed:
New file
2019-09-15 03:46:45,918 [salt.state       :1951][INFO    ][3237] Completed state [/etc/sudoers.d/90-salt-user-ubuntu] at time 03:46:45.918381 duration_in_ms=119.213
2019-09-15 03:46:45,918 [salt.state       :1780][INFO    ][3237] Running state [/etc/security/limits.d/90-salt-cis.conf] at time 03:46:45.918678
2019-09-15 03:46:45,919 [salt.state       :1813][INFO    ][3237] Executing state file.managed for [/etc/security/limits.d/90-salt-cis.conf]
2019-09-15 03:46:45,957 [salt.fileclient  :1219][INFO    ][3237] Fetching file from saltenv 'base', ** done ** 'linux/files/limits.conf'
2019-09-15 03:46:46,027 [salt.state       :300 ][INFO    ][3237] File changed:
New file
2019-09-15 03:46:46,027 [salt.state       :1951][INFO    ][3237] Completed state [/etc/security/limits.d/90-salt-cis.conf] at time 03:46:46.027854 duration_in_ms=109.174
2019-09-15 03:46:46,028 [salt.state       :1780][INFO    ][3237] Running state [/etc/security/limits.d/90-salt-default.conf] at time 03:46:46.028077
2019-09-15 03:46:46,028 [salt.state       :1813][INFO    ][3237] Executing state file.managed for [/etc/security/limits.d/90-salt-default.conf]
2019-09-15 03:46:46,103 [salt.state       :300 ][INFO    ][3237] File changed:
New file
2019-09-15 03:46:46,103 [salt.state       :1951][INFO    ][3237] Completed state [/etc/security/limits.d/90-salt-default.conf] at time 03:46:46.103481 duration_in_ms=75.404
2019-09-15 03:46:46,103 [salt.state       :1780][INFO    ][3237] Running state [autofs] at time 03:46:46.103663
2019-09-15 03:46:46,103 [salt.state       :1813][INFO    ][3237] Executing state service.disabled for [autofs]
2019-09-15 03:46:46,104 [salt.loaded.int.module.cmdmod:395 ][INFO    ][3237] Executing command ['systemctl', 'status', 'autofs.service', '-n', '0'] in directory '/root'
2019-09-15 03:46:46,117 [salt.state       :300 ][INFO    ][3237] The named service autofs is not available
2019-09-15 03:46:46,117 [salt.state       :1951][INFO    ][3237] Completed state [autofs] at time 03:46:46.117394 duration_in_ms=13.731
2019-09-15 03:46:46,117 [salt.state       :1780][INFO    ][3237] Running state [/etc/systemd/system.conf.d/90-salt.conf] at time 03:46:46.117700
2019-09-15 03:46:46,117 [salt.state       :1813][INFO    ][3237] Executing state file.managed for [/etc/systemd/system.conf.d/90-salt.conf]
2019-09-15 03:46:46,133 [salt.fileclient  :1219][INFO    ][3237] Fetching file from saltenv 'base', ** done ** 'linux/files/systemd.conf'
2019-09-15 03:46:46,199 [salt.state       :300 ][INFO    ][3237] File changed:
New file
2019-09-15 03:46:46,199 [salt.state       :1951][INFO    ][3237] Completed state [/etc/systemd/system.conf.d/90-salt.conf] at time 03:46:46.199753 duration_in_ms=82.053
2019-09-15 03:46:46,201 [salt.state       :1780][INFO    ][3237] Running state [service.systemctl_reload] at time 03:46:46.201735
2019-09-15 03:46:46,201 [salt.state       :1813][INFO    ][3237] Executing state module.wait for [service.systemctl_reload]
2019-09-15 03:46:46,202 [salt.state       :300 ][INFO    ][3237] No changes made for service.systemctl_reload
2019-09-15 03:46:46,202 [salt.state       :1951][INFO    ][3237] Completed state [service.systemctl_reload] at time 03:46:46.202251 duration_in_ms=0.516
2019-09-15 03:46:46,202 [salt.state       :1780][INFO    ][3237] Running state [service.systemctl_reload] at time 03:46:46.202393
2019-09-15 03:46:46,202 [salt.state       :1813][INFO    ][3237] Executing state module.mod_watch for [service.systemctl_reload]
2019-09-15 03:46:46,202 [salt.utils.decorators:613 ][WARNING ][3237] The function "module.run" is using its deprecated version and will expire in version "Sodium".
2019-09-15 03:46:46,203 [salt.loaded.int.module.cmdmod:395 ][INFO    ][3237] Executing command ['systemctl', '--system', 'daemon-reload'] in directory '/root'
2019-09-15 03:46:46,281 [salt.state       :300 ][INFO    ][3237] {'ret': True}
2019-09-15 03:46:46,282 [salt.state       :1951][INFO    ][3237] Completed state [service.systemctl_reload] at time 03:46:46.282119 duration_in_ms=79.726
2019-09-15 03:46:46,282 [salt.state       :1780][INFO    ][3237] Running state [/etc/shadow] at time 03:46:46.282453
2019-09-15 03:46:46,282 [salt.state       :1813][INFO    ][3237] Executing state file.managed for [/etc/shadow]
2019-09-15 03:46:46,283 [salt.loaded.int.states.file:2298][WARNING ][3237] State for file: /etc/shadow - 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.
2019-09-15 03:46:46,283 [salt.state       :300 ][INFO    ][3237] File /etc/shadow exists with proper permissions. No changes made.
2019-09-15 03:46:46,283 [salt.state       :1951][INFO    ][3237] Completed state [/etc/shadow] at time 03:46:46.283935 duration_in_ms=1.482
2019-09-15 03:46:46,284 [salt.state       :1780][INFO    ][3237] Running state [/etc/gshadow] at time 03:46:46.284132
2019-09-15 03:46:46,284 [salt.state       :1813][INFO    ][3237] Executing state file.managed for [/etc/gshadow]
2019-09-15 03:46:46,284 [salt.loaded.int.states.file:2298][WARNING ][3237] State for file: /etc/gshadow - 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.
2019-09-15 03:46:46,285 [salt.state       :300 ][INFO    ][3237] File /etc/gshadow exists with proper permissions. No changes made.
2019-09-15 03:46:46,285 [salt.state       :1951][INFO    ][3237] Completed state [/etc/gshadow] at time 03:46:46.285131 duration_in_ms=0.998
2019-09-15 03:46:46,285 [salt.state       :1780][INFO    ][3237] Running state [/etc/group] at time 03:46:46.285297
2019-09-15 03:46:46,285 [salt.state       :1813][INFO    ][3237] Executing state file.managed for [/etc/group]
2019-09-15 03:46:46,285 [salt.loaded.int.states.file:2298][WARNING ][3237] State for file: /etc/group - 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.
2019-09-15 03:46:46,286 [salt.state       :300 ][INFO    ][3237] File /etc/group exists with proper permissions. No changes made.
2019-09-15 03:46:46,286 [salt.state       :1951][INFO    ][3237] Completed state [/etc/group] at time 03:46:46.286244 duration_in_ms=0.947
2019-09-15 03:46:46,286 [salt.state       :1780][INFO    ][3237] Running state [/etc/group-] at time 03:46:46.286406
2019-09-15 03:46:46,286 [salt.state       :1813][INFO    ][3237] Executing state file.managed for [/etc/group-]
2019-09-15 03:46:46,286 [salt.loaded.int.states.file:2298][WARNING ][3237] State for file: /etc/group- - 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.
2019-09-15 03:46:46,287 [salt.state       :300 ][INFO    ][3237] File /etc/group- exists with proper permissions. No changes made.
2019-09-15 03:46:46,287 [salt.state       :1951][INFO    ][3237] Completed state [/etc/group-] at time 03:46:46.287400 duration_in_ms=0.993
2019-09-15 03:46:46,287 [salt.state       :1780][INFO    ][3237] Running state [/etc/passwd-] at time 03:46:46.287562
2019-09-15 03:46:46,287 [salt.state       :1813][INFO    ][3237] Executing state file.managed for [/etc/passwd-]
2019-09-15 03:46:46,287 [salt.loaded.int.states.file:2298][WARNING ][3237] State for file: /etc/passwd- - 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.
2019-09-15 03:46:46,288 [salt.state       :300 ][INFO    ][3237] File /etc/passwd- exists with proper permissions. No changes made.
2019-09-15 03:46:46,288 [salt.state       :1951][INFO    ][3237] Completed state [/etc/passwd-] at time 03:46:46.288510 duration_in_ms=0.948
2019-09-15 03:46:46,288 [salt.state       :1780][INFO    ][3237] Running state [/etc/passwd] at time 03:46:46.288674
2019-09-15 03:46:46,288 [salt.state       :1813][INFO    ][3237] Executing state file.managed for [/etc/passwd]
2019-09-15 03:46:46,289 [salt.loaded.int.states.file:2298][WARNING ][3237] State for file: /etc/passwd - 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.
2019-09-15 03:46:46,289 [salt.state       :300 ][INFO    ][3237] File /etc/passwd exists with proper permissions. No changes made.
2019-09-15 03:46:46,289 [salt.state       :1951][INFO    ][3237] Completed state [/etc/passwd] at time 03:46:46.289596 duration_in_ms=0.922
2019-09-15 03:46:46,289 [salt.state       :1780][INFO    ][3237] Running state [/etc/gshadow-] at time 03:46:46.289756
2019-09-15 03:46:46,289 [salt.state       :1813][INFO    ][3237] Executing state file.managed for [/etc/gshadow-]
2019-09-15 03:46:46,290 [salt.loaded.int.states.file:2298][WARNING ][3237] State for file: /etc/gshadow- - 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.
2019-09-15 03:46:46,290 [salt.state       :300 ][INFO    ][3237] File /etc/gshadow- exists with proper permissions. No changes made.
2019-09-15 03:46:46,290 [salt.state       :1951][INFO    ][3237] Completed state [/etc/gshadow-] at time 03:46:46.290707 duration_in_ms=0.951
2019-09-15 03:46:46,290 [salt.state       :1780][INFO    ][3237] Running state [/etc/shadow-] at time 03:46:46.290899
2019-09-15 03:46:46,291 [salt.state       :1813][INFO    ][3237] Executing state file.managed for [/etc/shadow-]
2019-09-15 03:46:46,291 [salt.loaded.int.states.file:2298][WARNING ][3237] State for file: /etc/shadow- - 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.
2019-09-15 03:46:46,291 [salt.state       :300 ][INFO    ][3237] File /etc/shadow- exists with proper permissions. No changes made.
2019-09-15 03:46:46,291 [salt.state       :1951][INFO    ][3237] Completed state [/etc/shadow-] at time 03:46:46.291867 duration_in_ms=0.969
2019-09-15 03:46:46,292 [salt.state       :1780][INFO    ][3237] Running state [/etc/apt/apt.conf.d/99prefer_ipv4-salt] at time 03:46:46.292054
2019-09-15 03:46:46,292 [salt.state       :1813][INFO    ][3237] Executing state file.managed for [/etc/apt/apt.conf.d/99prefer_ipv4-salt]
2019-09-15 03:46:46,308 [salt.fileclient  :1219][INFO    ][3237] Fetching file from saltenv 'base', ** done ** 'linux/files/apt.conf'
2019-09-15 03:46:46,316 [salt.state       :300 ][INFO    ][3237] File changed:
New file
2019-09-15 03:46:46,316 [salt.state       :1951][INFO    ][3237] Completed state [/etc/apt/apt.conf.d/99prefer_ipv4-salt] at time 03:46:46.316921 duration_in_ms=24.867
2019-09-15 03:46:46,317 [salt.state       :1780][INFO    ][3237] Running state [/etc/apt/apt.conf.d/99allow_downgrades-salt] at time 03:46:46.317094
2019-09-15 03:46:46,317 [salt.state       :1813][INFO    ][3237] Executing state file.managed for [/etc/apt/apt.conf.d/99allow_downgrades-salt]
2019-09-15 03:46:46,332 [salt.state       :300 ][INFO    ][3237] File changed:
New file
2019-09-15 03:46:46,332 [salt.state       :1951][INFO    ][3237] Completed state [/etc/apt/apt.conf.d/99allow_downgrades-salt] at time 03:46:46.332733 duration_in_ms=15.639
2019-09-15 03:46:46,332 [salt.state       :1780][INFO    ][3237] Running state [/etc/issue] at time 03:46:46.332902
2019-09-15 03:46:46,333 [salt.state       :1813][INFO    ][3237] Executing state file.managed for [/etc/issue]
2019-09-15 03:46:46,475 [salt.state       :300 ][INFO    ][3237] File changed:
--- 
+++ 
@@ -1,2 +1,9 @@
-Ubuntu 16.04.6 LTS \n \l
-
+=================================== WARNING ====================================
+You have accessed a computer managed by OPNFV.
+You are required to have authorization from OPNFV
+before you proceed and you are strictly limited to use set out within that
+authorization. Unauthorized access to or misuse of this system is prohibited
+and constitutes an offence under the Computer Misuse Act 1990.
+If you disclose any information obtained through this system without authority
+OPNFV may take legal action against you.
+================================================================================

2019-09-15 03:46:46,476 [salt.state       :1951][INFO    ][3237] Completed state [/etc/issue] at time 03:46:46.475946 duration_in_ms=143.044
2019-09-15 03:46:46,476 [salt.state       :1780][INFO    ][3237] Running state [/etc/hostname] at time 03:46:46.476177
2019-09-15 03:46:46,476 [salt.state       :1813][INFO    ][3237] Executing state file.managed for [/etc/hostname]
2019-09-15 03:46:46,492 [salt.fileclient  :1219][INFO    ][3237] Fetching file from saltenv 'base', ** done ** 'linux/files/hostname'
2019-09-15 03:46:46,497 [salt.state       :300 ][INFO    ][3237] File changed:
--- 
+++ 
@@ -1 +1 @@
-ubuntu
+odl01

2019-09-15 03:46:46,497 [salt.state       :1951][INFO    ][3237] Completed state [/etc/hostname] at time 03:46:46.497813 duration_in_ms=21.636
2019-09-15 03:46:46,499 [salt.state       :1780][INFO    ][3237] Running state [hostname odl01] at time 03:46:46.499771
2019-09-15 03:46:46,500 [salt.state       :1813][INFO    ][3237] Executing state cmd.run for [hostname odl01]
2019-09-15 03:46:46,500 [salt.loaded.int.module.cmdmod:395 ][INFO    ][3237] Executing command 'test "$(hostname)" = "odl01"' in directory '/root'
2019-09-15 03:46:46,512 [salt.loaded.int.module.cmdmod:395 ][INFO    ][3237] Executing command 'hostname odl01' in directory '/root'
2019-09-15 03:46:46,523 [salt.state       :300 ][INFO    ][3237] {'pid': 5596, 'retcode': 0, 'stderr': '', 'stdout': ''}
2019-09-15 03:46:46,523 [salt.state       :1951][INFO    ][3237] Completed state [hostname odl01] at time 03:46:46.523497 duration_in_ms=23.726
2019-09-15 03:46:46,524 [salt.state       :1780][INFO    ][3237] Running state [mdb02] at time 03:46:46.524721
2019-09-15 03:46:46,525 [salt.state       :1813][INFO    ][3237] Executing state host.present for [mdb02]
2019-09-15 03:46:46,525 [salt.state       :300 ][INFO    ][3237] {'host': 'mdb02'}
2019-09-15 03:46:46,526 [salt.state       :1951][INFO    ][3237] Completed state [mdb02] at time 03:46:46.526064 duration_in_ms=1.344
2019-09-15 03:46:46,526 [salt.state       :1780][INFO    ][3237] Running state [mdb02.mcp-odl-ha.local] at time 03:46:46.526334
2019-09-15 03:46:46,526 [salt.state       :1813][INFO    ][3237] Executing state host.present for [mdb02.mcp-odl-ha.local]
2019-09-15 03:46:46,607 [salt.state       :300 ][INFO    ][3237] {'host': 'mdb02.mcp-odl-ha.local'}
2019-09-15 03:46:46,607 [salt.state       :1951][INFO    ][3237] Completed state [mdb02.mcp-odl-ha.local] at time 03:46:46.607290 duration_in_ms=80.956
2019-09-15 03:46:46,607 [salt.state       :1780][INFO    ][3237] Running state [mdb03] at time 03:46:46.607614
2019-09-15 03:46:46,607 [salt.state       :1813][INFO    ][3237] Executing state host.present for [mdb03]
2019-09-15 03:46:46,804 [salt.state       :300 ][INFO    ][3237] {'host': 'mdb03'}
2019-09-15 03:46:46,805 [salt.state       :1951][INFO    ][3237] Completed state [mdb03] at time 03:46:46.805227 duration_in_ms=197.612
2019-09-15 03:46:46,805 [salt.state       :1780][INFO    ][3237] Running state [mdb03.mcp-odl-ha.local] at time 03:46:46.805667
2019-09-15 03:46:46,805 [salt.state       :1813][INFO    ][3237] Executing state host.present for [mdb03.mcp-odl-ha.local]
2019-09-15 03:46:46,936 [salt.state       :300 ][INFO    ][3237] {'host': 'mdb03.mcp-odl-ha.local'}
2019-09-15 03:46:46,937 [salt.state       :1951][INFO    ][3237] Completed state [mdb03.mcp-odl-ha.local] at time 03:46:46.937066 duration_in_ms=131.399
2019-09-15 03:46:46,937 [salt.state       :1780][INFO    ][3237] Running state [mdb01] at time 03:46:46.937493
2019-09-15 03:46:46,937 [salt.state       :1813][INFO    ][3237] Executing state host.present for [mdb01]
2019-09-15 03:46:46,942 [salt.state       :300 ][INFO    ][3237] {'host': 'mdb01'}
2019-09-15 03:46:46,942 [salt.state       :1951][INFO    ][3237] Completed state [mdb01] at time 03:46:46.942669 duration_in_ms=5.176
2019-09-15 03:46:46,943 [salt.state       :1780][INFO    ][3237] Running state [mdb01.mcp-odl-ha.local] at time 03:46:46.942978
2019-09-15 03:46:46,943 [salt.state       :1813][INFO    ][3237] Executing state host.present for [mdb01.mcp-odl-ha.local]
2019-09-15 03:46:46,948 [salt.state       :300 ][INFO    ][3237] {'host': 'mdb01.mcp-odl-ha.local'}
2019-09-15 03:46:46,948 [salt.state       :1951][INFO    ][3237] Completed state [mdb01.mcp-odl-ha.local] at time 03:46:46.948712 duration_in_ms=5.733
2019-09-15 03:46:46,949 [salt.state       :1780][INFO    ][3237] Running state [mdb] at time 03:46:46.949003
2019-09-15 03:46:46,949 [salt.state       :1813][INFO    ][3237] Executing state host.present for [mdb]
2019-09-15 03:46:46,954 [salt.state       :300 ][INFO    ][3237] {'host': 'mdb'}
2019-09-15 03:46:46,954 [salt.state       :1951][INFO    ][3237] Completed state [mdb] at time 03:46:46.954529 duration_in_ms=5.526
2019-09-15 03:46:46,954 [salt.state       :1780][INFO    ][3237] Running state [mdb.mcp-odl-ha.local] at time 03:46:46.954819
2019-09-15 03:46:46,955 [salt.state       :1813][INFO    ][3237] Executing state host.present for [mdb.mcp-odl-ha.local]
2019-09-15 03:46:46,996 [salt.state       :300 ][INFO    ][3237] {'host': 'mdb.mcp-odl-ha.local'}
2019-09-15 03:46:46,996 [salt.state       :1951][INFO    ][3237] Completed state [mdb.mcp-odl-ha.local] at time 03:46:46.996483 duration_in_ms=41.664
2019-09-15 03:46:46,996 [salt.state       :1780][INFO    ][3237] Running state [cfg01] at time 03:46:46.996788
2019-09-15 03:46:46,997 [salt.state       :1813][INFO    ][3237] Executing state host.present for [cfg01]
2019-09-15 03:46:47,080 [salt.state       :300 ][INFO    ][3237] {'host': 'cfg01'}
2019-09-15 03:46:47,080 [salt.state       :1951][INFO    ][3237] Completed state [cfg01] at time 03:46:47.080869 duration_in_ms=84.08
2019-09-15 03:46:47,081 [salt.state       :1780][INFO    ][3237] Running state [cfg01.mcp-odl-ha.local] at time 03:46:47.081289
2019-09-15 03:46:47,081 [salt.state       :1813][INFO    ][3237] Executing state host.present for [cfg01.mcp-odl-ha.local]
2019-09-15 03:46:47,086 [salt.state       :300 ][INFO    ][3237] {'host': 'cfg01.mcp-odl-ha.local'}
2019-09-15 03:46:47,086 [salt.state       :1951][INFO    ][3237] Completed state [cfg01.mcp-odl-ha.local] at time 03:46:47.086359 duration_in_ms=5.071
2019-09-15 03:46:47,086 [salt.state       :1780][INFO    ][3237] Running state [prx01] at time 03:46:47.086666
2019-09-15 03:46:47,086 [salt.state       :1813][INFO    ][3237] Executing state host.present for [prx01]
2019-09-15 03:46:47,092 [salt.state       :300 ][INFO    ][3237] {'host': 'prx01'}
2019-09-15 03:46:47,092 [salt.state       :1951][INFO    ][3237] Completed state [prx01] at time 03:46:47.092408 duration_in_ms=5.741
2019-09-15 03:46:47,092 [salt.state       :1780][INFO    ][3237] Running state [prx01.mcp-odl-ha.local] at time 03:46:47.092708
2019-09-15 03:46:47,092 [salt.state       :1813][INFO    ][3237] Executing state host.present for [prx01.mcp-odl-ha.local]
2019-09-15 03:46:47,096 [salt.state       :300 ][INFO    ][3237] {'host': 'prx01.mcp-odl-ha.local'}
2019-09-15 03:46:47,097 [salt.state       :1951][INFO    ][3237] Completed state [prx01.mcp-odl-ha.local] at time 03:46:47.096992 duration_in_ms=4.284
2019-09-15 03:46:47,097 [salt.state       :1780][INFO    ][3237] Running state [kvm01] at time 03:46:47.097286
2019-09-15 03:46:47,097 [salt.state       :1813][INFO    ][3237] Executing state host.present for [kvm01]
2019-09-15 03:46:47,102 [salt.state       :300 ][INFO    ][3237] {'host': 'kvm01'}
2019-09-15 03:46:47,103 [salt.state       :1951][INFO    ][3237] Completed state [kvm01] at time 03:46:47.103028 duration_in_ms=5.741
2019-09-15 03:46:47,103 [salt.state       :1780][INFO    ][3237] Running state [kvm01.mcp-odl-ha.local] at time 03:46:47.103322
2019-09-15 03:46:47,103 [salt.state       :1813][INFO    ][3237] Executing state host.present for [kvm01.mcp-odl-ha.local]
2019-09-15 03:46:47,108 [salt.state       :300 ][INFO    ][3237] {'host': 'kvm01.mcp-odl-ha.local'}
2019-09-15 03:46:47,109 [salt.state       :1951][INFO    ][3237] Completed state [kvm01.mcp-odl-ha.local] at time 03:46:47.109008 duration_in_ms=5.686
2019-09-15 03:46:47,109 [salt.state       :1780][INFO    ][3237] Running state [kvm03] at time 03:46:47.109309
2019-09-15 03:46:47,109 [salt.state       :1813][INFO    ][3237] Executing state host.present for [kvm03]
2019-09-15 03:46:47,114 [salt.state       :300 ][INFO    ][3237] {'host': 'kvm03'}
2019-09-15 03:46:47,115 [salt.state       :1951][INFO    ][3237] Completed state [kvm03] at time 03:46:47.115062 duration_in_ms=5.753
2019-09-15 03:46:47,115 [salt.state       :1780][INFO    ][3237] Running state [kvm03.mcp-odl-ha.local] at time 03:46:47.115360
2019-09-15 03:46:47,115 [salt.state       :1813][INFO    ][3237] Executing state host.present for [kvm03.mcp-odl-ha.local]
2019-09-15 03:46:47,120 [salt.state       :300 ][INFO    ][3237] {'host': 'kvm03.mcp-odl-ha.local'}
2019-09-15 03:46:47,121 [salt.state       :1951][INFO    ][3237] Completed state [kvm03.mcp-odl-ha.local] at time 03:46:47.121080 duration_in_ms=5.72
2019-09-15 03:46:47,121 [salt.state       :1780][INFO    ][3237] Running state [kvm02] at time 03:46:47.121372
2019-09-15 03:46:47,121 [salt.state       :1813][INFO    ][3237] Executing state host.present for [kvm02]
2019-09-15 03:46:47,127 [salt.state       :300 ][INFO    ][3237] {'host': 'kvm02'}
2019-09-15 03:46:47,127 [salt.state       :1951][INFO    ][3237] Completed state [kvm02] at time 03:46:47.127257 duration_in_ms=5.885
2019-09-15 03:46:47,127 [salt.state       :1780][INFO    ][3237] Running state [kvm02.mcp-odl-ha.local] at time 03:46:47.127557
2019-09-15 03:46:47,127 [salt.state       :1813][INFO    ][3237] Executing state host.present for [kvm02.mcp-odl-ha.local]
2019-09-15 03:46:47,204 [salt.state       :300 ][INFO    ][3237] {'host': 'kvm02.mcp-odl-ha.local'}
2019-09-15 03:46:47,205 [salt.state       :1951][INFO    ][3237] Completed state [kvm02.mcp-odl-ha.local] at time 03:46:47.205154 duration_in_ms=77.596
2019-09-15 03:46:47,205 [salt.state       :1780][INFO    ][3237] Running state [dbs] at time 03:46:47.205565
2019-09-15 03:46:47,205 [salt.state       :1813][INFO    ][3237] Executing state host.present for [dbs]
2019-09-15 03:46:47,282 [salt.state       :300 ][INFO    ][3237] {'host': 'dbs'}
2019-09-15 03:46:47,283 [salt.state       :1951][INFO    ][3237] Completed state [dbs] at time 03:46:47.283251 duration_in_ms=77.685
2019-09-15 03:46:47,283 [salt.state       :1780][INFO    ][3237] Running state [dbs.mcp-odl-ha.local] at time 03:46:47.283665
2019-09-15 03:46:47,283 [salt.state       :1813][INFO    ][3237] Executing state host.present for [dbs.mcp-odl-ha.local]
2019-09-15 03:46:47,288 [salt.state       :300 ][INFO    ][3237] {'host': 'dbs.mcp-odl-ha.local'}
2019-09-15 03:46:47,288 [salt.state       :1951][INFO    ][3237] Completed state [dbs.mcp-odl-ha.local] at time 03:46:47.288953 duration_in_ms=5.289
2019-09-15 03:46:47,289 [salt.state       :1780][INFO    ][3237] Running state [prx] at time 03:46:47.289263
2019-09-15 03:46:47,289 [salt.state       :1813][INFO    ][3237] Executing state host.present for [prx]
2019-09-15 03:46:47,294 [salt.state       :300 ][INFO    ][3237] {'host': 'prx'}
2019-09-15 03:46:47,295 [salt.state       :1951][INFO    ][3237] Completed state [prx] at time 03:46:47.295030 duration_in_ms=5.767
2019-09-15 03:46:47,295 [salt.state       :1780][INFO    ][3237] Running state [prx.mcp-odl-ha.local] at time 03:46:47.295320
2019-09-15 03:46:47,295 [salt.state       :1813][INFO    ][3237] Executing state host.present for [prx.mcp-odl-ha.local]
2019-09-15 03:46:47,300 [salt.state       :300 ][INFO    ][3237] {'host': 'prx.mcp-odl-ha.local'}
2019-09-15 03:46:47,301 [salt.state       :1951][INFO    ][3237] Completed state [prx.mcp-odl-ha.local] at time 03:46:47.301008 duration_in_ms=5.689
2019-09-15 03:46:47,301 [salt.state       :1780][INFO    ][3237] Running state [prx02] at time 03:46:47.301286
2019-09-15 03:46:47,301 [salt.state       :1813][INFO    ][3237] Executing state host.present for [prx02]
2019-09-15 03:46:47,306 [salt.state       :300 ][INFO    ][3237] {'host': 'prx02'}
2019-09-15 03:46:47,306 [salt.state       :1951][INFO    ][3237] Completed state [prx02] at time 03:46:47.306955 duration_in_ms=5.669
2019-09-15 03:46:47,307 [salt.state       :1780][INFO    ][3237] Running state [prx02.mcp-odl-ha.local] at time 03:46:47.307239
2019-09-15 03:46:47,307 [salt.state       :1813][INFO    ][3237] Executing state host.present for [prx02.mcp-odl-ha.local]
2019-09-15 03:46:47,426 [salt.state       :300 ][INFO    ][3237] {'host': 'prx02.mcp-odl-ha.local'}
2019-09-15 03:46:47,426 [salt.state       :1951][INFO    ][3237] Completed state [prx02.mcp-odl-ha.local] at time 03:46:47.426710 duration_in_ms=119.471
2019-09-15 03:46:47,427 [salt.state       :1780][INFO    ][3237] Running state [msg02] at time 03:46:47.427102
2019-09-15 03:46:47,427 [salt.state       :1813][INFO    ][3237] Executing state host.present for [msg02]
2019-09-15 03:46:47,432 [salt.state       :300 ][INFO    ][3237] {'host': 'msg02'}
2019-09-15 03:46:47,432 [salt.state       :1951][INFO    ][3237] Completed state [msg02] at time 03:46:47.432653 duration_in_ms=5.55
2019-09-15 03:46:47,433 [salt.state       :1780][INFO    ][3237] Running state [msg02.mcp-odl-ha.local] at time 03:46:47.433008
2019-09-15 03:46:47,433 [salt.state       :1813][INFO    ][3237] Executing state host.present for [msg02.mcp-odl-ha.local]
2019-09-15 03:46:47,438 [salt.state       :300 ][INFO    ][3237] {'host': 'msg02.mcp-odl-ha.local'}
2019-09-15 03:46:47,438 [salt.state       :1951][INFO    ][3237] Completed state [msg02.mcp-odl-ha.local] at time 03:46:47.438665 duration_in_ms=5.657
2019-09-15 03:46:47,439 [salt.state       :1780][INFO    ][3237] Running state [msg03] at time 03:46:47.439039
2019-09-15 03:46:47,439 [salt.state       :1813][INFO    ][3237] Executing state host.present for [msg03]
2019-09-15 03:46:47,444 [salt.state       :300 ][INFO    ][3237] {'host': 'msg03'}
2019-09-15 03:46:47,444 [salt.state       :1951][INFO    ][3237] Completed state [msg03] at time 03:46:47.444644 duration_in_ms=5.605
2019-09-15 03:46:47,445 [salt.state       :1780][INFO    ][3237] Running state [msg03.mcp-odl-ha.local] at time 03:46:47.444995
2019-09-15 03:46:47,445 [salt.state       :1813][INFO    ][3237] Executing state host.present for [msg03.mcp-odl-ha.local]
2019-09-15 03:46:47,451 [salt.state       :300 ][INFO    ][3237] {'host': 'msg03.mcp-odl-ha.local'}
2019-09-15 03:46:47,451 [salt.state       :1951][INFO    ][3237] Completed state [msg03.mcp-odl-ha.local] at time 03:46:47.451690 duration_in_ms=6.695
2019-09-15 03:46:47,452 [salt.state       :1780][INFO    ][3237] Running state [msg01] at time 03:46:47.452057
2019-09-15 03:46:47,452 [salt.state       :1813][INFO    ][3237] Executing state host.present for [msg01]
2019-09-15 03:46:47,457 [salt.state       :300 ][INFO    ][3237] {'host': 'msg01'}
2019-09-15 03:46:47,457 [salt.state       :1951][INFO    ][3237] Completed state [msg01] at time 03:46:47.457666 duration_in_ms=5.609
2019-09-15 03:46:47,458 [salt.state       :1780][INFO    ][3237] Running state [msg01.mcp-odl-ha.local] at time 03:46:47.458003
2019-09-15 03:46:47,458 [salt.state       :1813][INFO    ][3237] Executing state host.present for [msg01.mcp-odl-ha.local]
2019-09-15 03:46:47,463 [salt.state       :300 ][INFO    ][3237] {'host': 'msg01.mcp-odl-ha.local'}
2019-09-15 03:46:47,464 [salt.state       :1951][INFO    ][3237] Completed state [msg01.mcp-odl-ha.local] at time 03:46:47.463974 duration_in_ms=5.971
2019-09-15 03:46:47,464 [salt.state       :1780][INFO    ][3237] Running state [msg] at time 03:46:47.464304
2019-09-15 03:46:47,464 [salt.state       :1813][INFO    ][3237] Executing state host.present for [msg]
2019-09-15 03:46:47,469 [salt.state       :300 ][INFO    ][3237] {'host': 'msg'}
2019-09-15 03:46:47,469 [salt.state       :1951][INFO    ][3237] Completed state [msg] at time 03:46:47.469703 duration_in_ms=5.399
2019-09-15 03:46:47,470 [salt.state       :1780][INFO    ][3237] Running state [msg.mcp-odl-ha.local] at time 03:46:47.470032
2019-09-15 03:46:47,470 [salt.state       :1813][INFO    ][3237] Executing state host.present for [msg.mcp-odl-ha.local]
2019-09-15 03:46:47,475 [salt.state       :300 ][INFO    ][3237] {'host': 'msg.mcp-odl-ha.local'}
2019-09-15 03:46:47,475 [salt.state       :1951][INFO    ][3237] Completed state [msg.mcp-odl-ha.local] at time 03:46:47.475922 duration_in_ms=5.89
2019-09-15 03:46:47,476 [salt.state       :1780][INFO    ][3237] Running state [cfg01] at time 03:46:47.476282
2019-09-15 03:46:47,476 [salt.state       :1813][INFO    ][3237] Executing state host.present for [cfg01]
2019-09-15 03:46:47,476 [salt.state       :300 ][INFO    ][3237] Host cfg01 (10.167.4.11) already present
2019-09-15 03:46:47,477 [salt.state       :1951][INFO    ][3237] Completed state [cfg01] at time 03:46:47.477159 duration_in_ms=0.876
2019-09-15 03:46:47,477 [salt.state       :1780][INFO    ][3237] Running state [cfg01.mcp-odl-ha.local] at time 03:46:47.477497
2019-09-15 03:46:47,477 [salt.state       :1813][INFO    ][3237] Executing state host.present for [cfg01.mcp-odl-ha.local]
2019-09-15 03:46:47,478 [salt.state       :300 ][INFO    ][3237] Host cfg01.mcp-odl-ha.local (10.167.4.11) already present
2019-09-15 03:46:47,478 [salt.state       :1951][INFO    ][3237] Completed state [cfg01.mcp-odl-ha.local] at time 03:46:47.478388 duration_in_ms=0.891
2019-09-15 03:46:47,478 [salt.state       :1780][INFO    ][3237] Running state [cmp002] at time 03:46:47.478735
2019-09-15 03:46:47,479 [salt.state       :1813][INFO    ][3237] Executing state host.present for [cmp002]
2019-09-15 03:46:47,583 [salt.state       :300 ][INFO    ][3237] {'host': 'cmp002'}
2019-09-15 03:46:47,584 [salt.state       :1951][INFO    ][3237] Completed state [cmp002] at time 03:46:47.584096 duration_in_ms=105.361
2019-09-15 03:46:47,584 [salt.state       :1780][INFO    ][3237] Running state [cmp002.mcp-odl-ha.local] at time 03:46:47.584533
2019-09-15 03:46:47,584 [salt.state       :1813][INFO    ][3237] Executing state host.present for [cmp002.mcp-odl-ha.local]
2019-09-15 03:46:47,589 [salt.state       :300 ][INFO    ][3237] {'host': 'cmp002.mcp-odl-ha.local'}
2019-09-15 03:46:47,589 [salt.state       :1951][INFO    ][3237] Completed state [cmp002.mcp-odl-ha.local] at time 03:46:47.589593 duration_in_ms=5.06
2019-09-15 03:46:47,589 [salt.state       :1780][INFO    ][3237] Running state [cmp001] at time 03:46:47.589897
2019-09-15 03:46:47,590 [salt.state       :1813][INFO    ][3237] Executing state host.present for [cmp001]
2019-09-15 03:46:47,595 [salt.state       :300 ][INFO    ][3237] {'host': 'cmp001'}
2019-09-15 03:46:47,595 [salt.state       :1951][INFO    ][3237] Completed state [cmp001] at time 03:46:47.595561 duration_in_ms=5.664
2019-09-15 03:46:47,595 [salt.state       :1780][INFO    ][3237] Running state [cmp001.mcp-odl-ha.local] at time 03:46:47.595910
2019-09-15 03:46:47,596 [salt.state       :1813][INFO    ][3237] Executing state host.present for [cmp001.mcp-odl-ha.local]
2019-09-15 03:46:47,601 [salt.state       :300 ][INFO    ][3237] {'host': 'cmp001.mcp-odl-ha.local'}
2019-09-15 03:46:47,601 [salt.state       :1951][INFO    ][3237] Completed state [cmp001.mcp-odl-ha.local] at time 03:46:47.601538 duration_in_ms=5.627
2019-09-15 03:46:47,601 [salt.state       :1780][INFO    ][3237] Running state [dbs01] at time 03:46:47.601850
2019-09-15 03:46:47,602 [salt.state       :1813][INFO    ][3237] Executing state host.present for [dbs01]
2019-09-15 03:46:47,709 [salt.state       :300 ][INFO    ][3237] {'host': 'dbs01'}
2019-09-15 03:46:47,709 [salt.state       :1951][INFO    ][3237] Completed state [dbs01] at time 03:46:47.709854 duration_in_ms=108.003
2019-09-15 03:46:47,710 [salt.state       :1780][INFO    ][3237] Running state [dbs01.mcp-odl-ha.local] at time 03:46:47.710298
2019-09-15 03:46:47,710 [salt.state       :1813][INFO    ][3237] Executing state host.present for [dbs01.mcp-odl-ha.local]
2019-09-15 03:46:47,739 [salt.state       :300 ][INFO    ][3237] {'host': 'dbs01.mcp-odl-ha.local'}
2019-09-15 03:46:47,739 [salt.state       :1951][INFO    ][3237] Completed state [dbs01.mcp-odl-ha.local] at time 03:46:47.739503 duration_in_ms=29.205
2019-09-15 03:46:47,739 [salt.state       :1780][INFO    ][3237] Running state [dbs02] at time 03:46:47.739857
2019-09-15 03:46:47,740 [salt.state       :1813][INFO    ][3237] Executing state host.present for [dbs02]
2019-09-15 03:46:47,757 [salt.state       :300 ][INFO    ][3237] {'host': 'dbs02'}
2019-09-15 03:46:47,757 [salt.state       :1951][INFO    ][3237] Completed state [dbs02] at time 03:46:47.757383 duration_in_ms=17.526
2019-09-15 03:46:47,757 [salt.state       :1780][INFO    ][3237] Running state [dbs02.mcp-odl-ha.local] at time 03:46:47.757735
2019-09-15 03:46:47,757 [salt.state       :1813][INFO    ][3237] Executing state host.present for [dbs02.mcp-odl-ha.local]
2019-09-15 03:46:47,763 [salt.state       :300 ][INFO    ][3237] {'host': 'dbs02.mcp-odl-ha.local'}
2019-09-15 03:46:47,763 [salt.state       :1951][INFO    ][3237] Completed state [dbs02.mcp-odl-ha.local] at time 03:46:47.763434 duration_in_ms=5.699
2019-09-15 03:46:47,763 [salt.state       :1780][INFO    ][3237] Running state [dbs03] at time 03:46:47.763783
2019-09-15 03:46:47,764 [salt.state       :1813][INFO    ][3237] Executing state host.present for [dbs03]
2019-09-15 03:46:47,769 [salt.state       :300 ][INFO    ][3237] {'host': 'dbs03'}
2019-09-15 03:46:47,769 [salt.state       :1951][INFO    ][3237] Completed state [dbs03] at time 03:46:47.769439 duration_in_ms=5.655
2019-09-15 03:46:47,769 [salt.state       :1780][INFO    ][3237] Running state [dbs03.mcp-odl-ha.local] at time 03:46:47.769793
2019-09-15 03:46:47,770 [salt.state       :1813][INFO    ][3237] Executing state host.present for [dbs03.mcp-odl-ha.local]
2019-09-15 03:46:47,775 [salt.state       :300 ][INFO    ][3237] {'host': 'dbs03.mcp-odl-ha.local'}
2019-09-15 03:46:47,775 [salt.state       :1951][INFO    ][3237] Completed state [dbs03.mcp-odl-ha.local] at time 03:46:47.775530 duration_in_ms=5.737
2019-09-15 03:46:47,775 [salt.state       :1780][INFO    ][3237] Running state [odl02] at time 03:46:47.775888
2019-09-15 03:46:47,776 [salt.state       :1813][INFO    ][3237] Executing state host.present for [odl02]
2019-09-15 03:46:47,781 [salt.state       :300 ][INFO    ][3237] {'host': 'odl02'}
2019-09-15 03:46:47,781 [salt.state       :1951][INFO    ][3237] Completed state [odl02] at time 03:46:47.781331 duration_in_ms=5.443
2019-09-15 03:46:47,781 [salt.state       :1780][INFO    ][3237] Running state [odl02.mcp-odl-ha.local] at time 03:46:47.781688
2019-09-15 03:46:47,781 [salt.state       :1813][INFO    ][3237] Executing state host.present for [odl02.mcp-odl-ha.local]
2019-09-15 03:46:47,791 [salt.state       :300 ][INFO    ][3237] {'host': 'odl02.mcp-odl-ha.local'}
2019-09-15 03:46:47,792 [salt.state       :1951][INFO    ][3237] Completed state [odl02.mcp-odl-ha.local] at time 03:46:47.792141 duration_in_ms=10.453
2019-09-15 03:46:47,792 [salt.state       :1780][INFO    ][3237] Running state [odl03] at time 03:46:47.792498
2019-09-15 03:46:47,792 [salt.state       :1813][INFO    ][3237] Executing state host.present for [odl03]
2019-09-15 03:46:47,797 [salt.state       :300 ][INFO    ][3237] {'host': 'odl03'}
2019-09-15 03:46:47,798 [salt.state       :1951][INFO    ][3237] Completed state [odl03] at time 03:46:47.798146 duration_in_ms=5.648
2019-09-15 03:46:47,798 [salt.state       :1780][INFO    ][3237] Running state [odl03.mcp-odl-ha.local] at time 03:46:47.798512
2019-09-15 03:46:47,798 [salt.state       :1813][INFO    ][3237] Executing state host.present for [odl03.mcp-odl-ha.local]
2019-09-15 03:46:47,836 [salt.state       :300 ][INFO    ][3237] {'host': 'odl03.mcp-odl-ha.local'}
2019-09-15 03:46:47,837 [salt.state       :1951][INFO    ][3237] Completed state [odl03.mcp-odl-ha.local] at time 03:46:47.837159 duration_in_ms=38.647
2019-09-15 03:46:47,837 [salt.state       :1780][INFO    ][3237] Running state [odl01] at time 03:46:47.837515
2019-09-15 03:46:47,837 [salt.state       :1813][INFO    ][3237] Executing state host.present for [odl01]
2019-09-15 03:46:47,959 [salt.state       :300 ][INFO    ][3237] {'host': 'odl01'}
2019-09-15 03:46:47,959 [salt.state       :1951][INFO    ][3237] Completed state [odl01] at time 03:46:47.959840 duration_in_ms=122.324
2019-09-15 03:46:47,960 [salt.state       :1780][INFO    ][3237] Running state [odl01.mcp-odl-ha.local] at time 03:46:47.960255
2019-09-15 03:46:47,960 [salt.state       :1813][INFO    ][3237] Executing state host.present for [odl01.mcp-odl-ha.local]
2019-09-15 03:46:47,965 [salt.state       :300 ][INFO    ][3237] {'host': 'odl01.mcp-odl-ha.local'}
2019-09-15 03:46:47,965 [salt.state       :1951][INFO    ][3237] Completed state [odl01.mcp-odl-ha.local] at time 03:46:47.965605 duration_in_ms=5.35
2019-09-15 03:46:47,965 [salt.state       :1780][INFO    ][3237] Running state [mas01] at time 03:46:47.965944
2019-09-15 03:46:47,966 [salt.state       :1813][INFO    ][3237] Executing state host.present for [mas01]
2019-09-15 03:46:47,971 [salt.state       :300 ][INFO    ][3237] {'host': 'mas01'}
2019-09-15 03:46:47,971 [salt.state       :1951][INFO    ][3237] Completed state [mas01] at time 03:46:47.971588 duration_in_ms=5.644
2019-09-15 03:46:47,971 [salt.state       :1780][INFO    ][3237] Running state [mas01.mcp-odl-ha.local] at time 03:46:47.971915
2019-09-15 03:46:47,972 [salt.state       :1813][INFO    ][3237] Executing state host.present for [mas01.mcp-odl-ha.local]
2019-09-15 03:46:47,977 [salt.state       :300 ][INFO    ][3237] {'host': 'mas01.mcp-odl-ha.local'}
2019-09-15 03:46:47,977 [salt.state       :1951][INFO    ][3237] Completed state [mas01.mcp-odl-ha.local] at time 03:46:47.977621 duration_in_ms=5.706
2019-09-15 03:46:47,977 [salt.state       :1780][INFO    ][3237] Running state [ctl02] at time 03:46:47.977952
2019-09-15 03:46:47,978 [salt.state       :1813][INFO    ][3237] Executing state host.present for [ctl02]
2019-09-15 03:46:48,085 [salt.state       :300 ][INFO    ][3237] {'host': 'ctl02'}
2019-09-15 03:46:48,085 [salt.state       :1951][INFO    ][3237] Completed state [ctl02] at time 03:46:48.085745 duration_in_ms=107.793
2019-09-15 03:46:48,086 [salt.state       :1780][INFO    ][3237] Running state [ctl02.mcp-odl-ha.local] at time 03:46:48.086124
2019-09-15 03:46:48,086 [salt.state       :1813][INFO    ][3237] Executing state host.present for [ctl02.mcp-odl-ha.local]
2019-09-15 03:46:48,127 [salt.state       :300 ][INFO    ][3237] {'host': 'ctl02.mcp-odl-ha.local'}
2019-09-15 03:46:48,127 [salt.state       :1951][INFO    ][3237] Completed state [ctl02.mcp-odl-ha.local] at time 03:46:48.127575 duration_in_ms=41.451
2019-09-15 03:46:48,128 [salt.state       :1780][INFO    ][3237] Running state [ctl03] at time 03:46:48.127942
2019-09-15 03:46:48,128 [salt.state       :1813][INFO    ][3237] Executing state host.present for [ctl03]
2019-09-15 03:46:48,133 [salt.state       :300 ][INFO    ][3237] {'host': 'ctl03'}
2019-09-15 03:46:48,133 [salt.state       :1951][INFO    ][3237] Completed state [ctl03] at time 03:46:48.133605 duration_in_ms=5.663
2019-09-15 03:46:48,134 [salt.state       :1780][INFO    ][3237] Running state [ctl03.mcp-odl-ha.local] at time 03:46:48.133972
2019-09-15 03:46:48,134 [salt.state       :1813][INFO    ][3237] Executing state host.present for [ctl03.mcp-odl-ha.local]
2019-09-15 03:46:48,139 [salt.state       :300 ][INFO    ][3237] {'host': 'ctl03.mcp-odl-ha.local'}
2019-09-15 03:46:48,139 [salt.state       :1951][INFO    ][3237] Completed state [ctl03.mcp-odl-ha.local] at time 03:46:48.139551 duration_in_ms=5.58
2019-09-15 03:46:48,139 [salt.state       :1780][INFO    ][3237] Running state [ctl01] at time 03:46:48.139923
2019-09-15 03:46:48,140 [salt.state       :1813][INFO    ][3237] Executing state host.present for [ctl01]
2019-09-15 03:46:48,145 [salt.state       :300 ][INFO    ][3237] {'host': 'ctl01'}
2019-09-15 03:46:48,145 [salt.state       :1951][INFO    ][3237] Completed state [ctl01] at time 03:46:48.145601 duration_in_ms=5.678
2019-09-15 03:46:48,146 [salt.state       :1780][INFO    ][3237] Running state [ctl01.mcp-odl-ha.local] at time 03:46:48.145963
2019-09-15 03:46:48,146 [salt.state       :1813][INFO    ][3237] Executing state host.present for [ctl01.mcp-odl-ha.local]
2019-09-15 03:46:48,151 [salt.state       :300 ][INFO    ][3237] {'host': 'ctl01.mcp-odl-ha.local'}
2019-09-15 03:46:48,151 [salt.state       :1951][INFO    ][3237] Completed state [ctl01.mcp-odl-ha.local] at time 03:46:48.151604 duration_in_ms=5.64
2019-09-15 03:46:48,152 [salt.state       :1780][INFO    ][3237] Running state [ctl] at time 03:46:48.152009
2019-09-15 03:46:48,152 [salt.state       :1813][INFO    ][3237] Executing state host.present for [ctl]
2019-09-15 03:46:48,157 [salt.state       :300 ][INFO    ][3237] {'host': 'ctl'}
2019-09-15 03:46:48,157 [salt.state       :1951][INFO    ][3237] Completed state [ctl] at time 03:46:48.157599 duration_in_ms=5.59
2019-09-15 03:46:48,158 [salt.state       :1780][INFO    ][3237] Running state [ctl.mcp-odl-ha.local] at time 03:46:48.157968
2019-09-15 03:46:48,158 [salt.state       :1813][INFO    ][3237] Executing state host.present for [ctl.mcp-odl-ha.local]
2019-09-15 03:46:48,163 [salt.state       :300 ][INFO    ][3237] {'host': 'ctl.mcp-odl-ha.local'}
2019-09-15 03:46:48,163 [salt.state       :1951][INFO    ][3237] Completed state [ctl.mcp-odl-ha.local] at time 03:46:48.163639 duration_in_ms=5.671
2019-09-15 03:46:48,163 [salt.state       :1780][INFO    ][3237] Running state [/etc/network/interfaces.d/50-cloud-init.cfg] at time 03:46:48.163883
2019-09-15 03:46:48,164 [salt.state       :1813][INFO    ][3237] Executing state file.absent for [/etc/network/interfaces.d/50-cloud-init.cfg]
2019-09-15 03:46:48,164 [salt.state       :300 ][INFO    ][3237] {'removed': '/etc/network/interfaces.d/50-cloud-init.cfg'}
2019-09-15 03:46:48,164 [salt.state       :1951][INFO    ][3237] Completed state [/etc/network/interfaces.d/50-cloud-init.cfg] at time 03:46:48.164800 duration_in_ms=0.916
2019-09-15 03:46:48,165 [salt.state       :1780][INFO    ][3237] Running state [ens3] at time 03:46:48.165532
2019-09-15 03:46:48,165 [salt.state       :1813][INFO    ][3237] Executing state network.managed for [ens3]
2019-09-15 03:46:48,388 [salt.loaded.int.module.cmdmod:395 ][INFO    ][3237] Executing command ['ifup', 'ens3'] in directory '/root'
2019-09-15 03:46:49,019 [salt.state       :300 ][INFO    ][3237] {'interface': 'Added network interface.', 'status': 'Interface ens3 is up'}
2019-09-15 03:46:49,020 [salt.state       :1951][INFO    ][3237] Completed state [ens3] at time 03:46:49.020350 duration_in_ms=854.816
2019-09-15 03:46:49,020 [salt.state       :1780][INFO    ][3237] Running state [ens2] at time 03:46:49.020776
2019-09-15 03:46:49,021 [salt.state       :1813][INFO    ][3237] Executing state network.managed for [ens2]
2019-09-15 03:46:49,053 [salt.state       :300 ][INFO    ][3237] {'interface': 'Added network interface.'}
2019-09-15 03:46:49,054 [salt.state       :1951][INFO    ][3237] Completed state [ens2] at time 03:46:49.054158 duration_in_ms=33.383
2019-09-15 03:46:49,054 [salt.state       :1780][INFO    ][3237] Running state [linux_system_network] at time 03:46:49.054485
2019-09-15 03:46:49,054 [salt.state       :1813][INFO    ][3237] Executing state network.system for [linux_system_network]
2019-09-15 03:46:49,055 [salt.loaded.int.module.cmdmod:395 ][INFO    ][3237] Executing command ['systemctl', 'status', 'networking.service', '-n', '0'] in directory '/root'
2019-09-15 03:46:49,073 [salt.loaded.int.module.cmdmod:395 ][INFO    ][3237] Executing command ['systemctl', 'is-active', 'networking.service'] in directory '/root'
2019-09-15 03:46:49,100 [salt.loaded.int.module.cmdmod:395 ][INFO    ][3237] Executing command ['systemctl', 'status', 'NetworkManager.service', '-n', '0'] in directory '/root'
2019-09-15 03:46:49,119 [salt.loaded.int.module.cmdmod:395 ][INFO    ][3237] Executing command ['systemd-run', '--scope', 'systemctl', 'enable', 'networking.service'] in directory '/root'
2019-09-15 03:46:49,479 [salt.minion      :1308][INFO    ][3138] User sudo_ubuntu Executing command saltutil.find_job with jid 20190915034649051508
2019-09-15 03:46:49,490 [salt.minion      :1432][INFO    ][5798] Starting a new job with PID 5798
2019-09-15 03:46:49,504 [salt.minion      :1711][INFO    ][5798] Returning information for job: 20190915034649051508
2019-09-15 03:46:49,532 [salt.loaded.int.module.debian_ip:1964][WARNING ][3237] The network state sls is requiring a reboot of the system to properly apply network configuration.
2019-09-15 03:46:49,533 [salt.state       :300 ][INFO    ][3237] {'network_settings': u'--- \n+++ \n@@ -1,2 +1,4 @@\n NETWORKING=yes\n\n HOSTNAME=odl01\n\n+DOMAIN=mcp-odl-ha.local\n\n+SEARCH=maas\n'}
2019-09-15 03:46:49,533 [salt.state       :1951][INFO    ][3237] Completed state [linux_system_network] at time 03:46:49.533391 duration_in_ms=478.905
2019-09-15 03:46:49,533 [salt.state       :1780][INFO    ][3237] Running state [/etc/udev/rules.d/60-net-txqueue.rules] at time 03:46:49.533710
2019-09-15 03:46:49,534 [salt.state       :1813][INFO    ][3237] Executing state file.managed for [/etc/udev/rules.d/60-net-txqueue.rules]
2019-09-15 03:46:49,551 [salt.fileclient  :1219][INFO    ][3237] Fetching file from saltenv 'base', ** done ** 'linux/files/60-net-txqueue.rules'
2019-09-15 03:46:49,558 [salt.state       :300 ][INFO    ][3237] File changed:
New file
2019-09-15 03:46:49,559 [salt.state       :1951][INFO    ][3237] Completed state [/etc/udev/rules.d/60-net-txqueue.rules] at time 03:46:49.559019 duration_in_ms=25.308
2019-09-15 03:46:49,560 [salt.state       :1780][INFO    ][3237] Running state [/bin/udevadm control --reload-rules] at time 03:46:49.560918
2019-09-15 03:46:49,561 [salt.state       :1813][INFO    ][3237] Executing state cmd.run for [/bin/udevadm control --reload-rules]
2019-09-15 03:46:49,561 [salt.loaded.int.module.cmdmod:395 ][INFO    ][3237] Executing command '/bin/udevadm control --reload-rules' in directory '/root'
2019-09-15 03:46:49,574 [salt.state       :300 ][INFO    ][3237] {'pid': 5826, 'retcode': 0, 'stderr': '', 'stdout': ''}
2019-09-15 03:46:49,575 [salt.state       :1951][INFO    ][3237] Completed state [/bin/udevadm control --reload-rules] at time 03:46:49.575162 duration_in_ms=14.244
2019-09-15 03:46:49,577 [salt.state       :1780][INFO    ][3237] Running state [/bin/udevadm trigger --attr-match=subsystem=net] at time 03:46:49.577224
2019-09-15 03:46:49,577 [salt.state       :1813][INFO    ][3237] Executing state cmd.run for [/bin/udevadm trigger --attr-match=subsystem=net]
2019-09-15 03:46:49,578 [salt.loaded.int.module.cmdmod:395 ][INFO    ][3237] Executing command '/bin/udevadm trigger --attr-match=subsystem=net' in directory '/root'
2019-09-15 03:46:49,611 [salt.state       :300 ][INFO    ][3237] {'pid': 5828, 'retcode': 0, 'stderr': '', 'stdout': ''}
2019-09-15 03:46:49,611 [salt.state       :1951][INFO    ][3237] Completed state [/bin/udevadm trigger --attr-match=subsystem=net] at time 03:46:49.611664 duration_in_ms=34.439
2019-09-15 03:46:49,612 [salt.state       :1780][INFO    ][3237] Running state [/etc/profile.d/proxy.sh] at time 03:46:49.612075
2019-09-15 03:46:49,612 [salt.state       :1813][INFO    ][3237] Executing state file.absent for [/etc/profile.d/proxy.sh]
2019-09-15 03:46:49,612 [salt.state       :300 ][INFO    ][3237] File /etc/profile.d/proxy.sh is not present
2019-09-15 03:46:49,613 [salt.state       :1951][INFO    ][3237] Completed state [/etc/profile.d/proxy.sh] at time 03:46:49.613025 duration_in_ms=0.95
2019-09-15 03:46:49,614 [salt.state       :1780][INFO    ][3237] Running state [/etc/apt/apt.conf.d/95proxies] at time 03:46:49.613978
2019-09-15 03:46:49,614 [salt.state       :1813][INFO    ][3237] Executing state file.absent for [/etc/apt/apt.conf.d/95proxies]
2019-09-15 03:46:49,614 [salt.state       :300 ][INFO    ][3237] File /etc/apt/apt.conf.d/95proxies is not present
2019-09-15 03:46:49,614 [salt.state       :1951][INFO    ][3237] Completed state [/etc/apt/apt.conf.d/95proxies] at time 03:46:49.614759 duration_in_ms=0.783
2019-09-15 03:46:49,616 [salt.state       :1780][INFO    ][3237] Running state [/dev/shm] at time 03:46:49.616023
2019-09-15 03:46:49,616 [salt.state       :1813][INFO    ][3237] Executing state mount.mounted for [/dev/shm]
2019-09-15 03:46:49,616 [salt.loaded.int.module.cmdmod:395 ][INFO    ][3237] Executing command 'mount -l' in directory '/root'
2019-09-15 03:46:49,632 [salt.loaded.int.module.cmdmod:395 ][INFO    ][3237] Executing command 'blkid' in directory '/root'
2019-09-15 03:46:49,647 [salt.loaded.int.module.cmdmod:395 ][INFO    ][3237] Executing command 'mount -l' in directory '/root'
2019-09-15 03:46:49,660 [salt.loaded.int.module.cmdmod:395 ][INFO    ][3237] Executing command 'mount -o rw,nosuid,nodev,noexec,relatime,remount -t tmpfs shm /dev/shm' in directory '/root'
2019-09-15 03:46:49,670 [salt.loaded.int.module.cmdmod:395 ][INFO    ][3237] Executing command 'mount -l' in directory '/root'
2019-09-15 03:46:49,682 [salt.loaded.int.module.cmdmod:395 ][INFO    ][3237] Executing command 'mount -o rw,nosuid,nodev,noexec,relatime,remount -t tmpfs shm /dev/shm' in directory '/root'
2019-09-15 03:46:49,691 [salt.loaded.int.module.cmdmod:395 ][INFO    ][3237] Executing command 'mount -l' in directory '/root'
2019-09-15 03:46:49,703 [salt.loaded.int.module.cmdmod:395 ][INFO    ][3237] Executing command 'umount /dev/shm' in directory '/root'
2019-09-15 03:46:49,712 [salt.loaded.int.module.cmdmod:730 ][ERROR   ][3237] Command '['umount', '/dev/shm']' failed with return code: 32
2019-09-15 03:46:49,712 [salt.loaded.int.module.cmdmod:734 ][ERROR   ][3237] stderr: umount: /dev/shm: target is busy
        (In some cases useful info about processes that
         use the device is found by lsof(8) or fuser(1).)
2019-09-15 03:46:49,713 [salt.loaded.int.module.cmdmod:736 ][ERROR   ][3237] retcode: 32
2019-09-15 03:46:49,713 [salt.loaded.int.module.cmdmod:395 ][INFO    ][3237] Executing command 'mount -l' in directory '/root'
2019-09-15 03:46:49,727 [salt.loaded.int.module.cmdmod:395 ][INFO    ][3237] Executing command 'blkid' in directory '/root'
2019-09-15 03:46:49,740 [salt.state       :300 ][INFO    ][3237] {'umount': "Forced unmount because devices don't match. Wanted: shm, current: tmpfs, /tmpfs"}
2019-09-15 03:46:49,740 [salt.state       :1951][INFO    ][3237] Completed state [/dev/shm] at time 03:46:49.740843 duration_in_ms=124.82
2019-09-15 03:46:49,742 [salt.state       :1780][INFO    ][3237] Running state [ntp] at time 03:46:49.742707
2019-09-15 03:46:49,742 [salt.state       :1813][INFO    ][3237] Executing state pkg.installed for [ntp]
2019-09-15 03:46:49,898 [salt.loaded.int.module.cmdmod:395 ][INFO    ][3237] Executing command ['dpkg', '--get-selections', '*'] in directory '/root'
2019-09-15 03:46:49,917 [salt.loaded.int.module.cmdmod:395 ][INFO    ][3237] Executing command ['systemd-run', '--scope', 'apt-get', '-q', '-y', '-o', 'DPkg::Options::=--force-confold', '-o', 'DPkg::Options::=--force-confdef', 'install', 'ntp'] in directory '/root'
2019-09-15 03:47:07,344 [salt.loaded.int.module.cmdmod:395 ][INFO    ][3237] Executing command ['dpkg-query', '--showformat', '${Status} ${Package} ${Version} ${Architecture}', '-W'] in directory '/root'
2019-09-15 03:47:07,372 [salt.state       :300 ][INFO    ][3237] Made the following changes:
'ntp' changed from 'absent' to '1:4.2.8p4+dfsg-3ubuntu5.9'
'libopts25' changed from 'absent' to '1:5.18.7-3'

2019-09-15 03:47:07,387 [salt.state       :915 ][INFO    ][3237] Loading fresh modules for state activity
2019-09-15 03:47:07,412 [salt.state       :1951][INFO    ][3237] Completed state [ntp] at time 03:47:07.412595 duration_in_ms=17669.888
2019-09-15 03:47:07,416 [salt.state       :1780][INFO    ][3237] Running state [/etc/ntp.conf] at time 03:47:07.416583
2019-09-15 03:47:07,416 [salt.state       :1813][INFO    ][3237] Executing state file.managed for [/etc/ntp.conf]
2019-09-15 03:47:07,436 [salt.fileclient  :1219][INFO    ][3237] Fetching file from saltenv 'base', ** done ** 'ntp/files/ntp.conf'
2019-09-15 03:47:07,484 [salt.state       :300 ][INFO    ][3237] File changed:
--- 
+++ 
@@ -1,66 +1,25 @@
-# /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
+logfile /var/log/ntp.log
+server 1.pool.ntp.org iburst
 
-# 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
+# Exchange time with everybody, but don't allow configuration.
+restrict -4 default kod nomodify notrap nopeer noquery
+restrict -6 default kod nomodify notrap nopeer noquery
 
-# 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 127.0.0.1
 restrict ::1
 
-# Needed for adding pool entries
-restrict source notrap nomodify noquery
+# mode7 is required for collectd monitoring
 
-# Clients from this (example!) subnet have unlimited access, but only if
-# cryptographically authenticated.
-#restrict 192.168.123.0 mask 255.255.255.0 notrust
-
-
-# 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

2019-09-15 03:47:07,487 [salt.state       :1951][INFO    ][3237] Completed state [/etc/ntp.conf] at time 03:47:07.487056 duration_in_ms=70.472
2019-09-15 03:47:07,827 [salt.state       :1780][INFO    ][3237] Running state [ntp] at time 03:47:07.827431
2019-09-15 03:47:07,827 [salt.state       :1813][INFO    ][3237] Executing state service.running for [ntp]
2019-09-15 03:47:07,828 [salt.loaded.int.module.cmdmod:395 ][INFO    ][3237] Executing command ['systemctl', 'status', 'ntp.service', '-n', '0'] in directory '/root'
2019-09-15 03:47:07,842 [salt.loaded.int.module.cmdmod:395 ][INFO    ][3237] Executing command ['systemctl', 'is-active', 'ntp.service'] in directory '/root'
2019-09-15 03:47:07,853 [salt.loaded.int.module.cmdmod:395 ][INFO    ][3237] Executing command ['systemctl', 'is-enabled', 'ntp.service'] in directory '/root'
2019-09-15 03:47:07,868 [salt.state       :300 ][INFO    ][3237] The service ntp is already running
2019-09-15 03:47:07,868 [salt.state       :1951][INFO    ][3237] Completed state [ntp] at time 03:47:07.868387 duration_in_ms=40.957
2019-09-15 03:47:07,868 [salt.state       :1780][INFO    ][3237] Running state [ntp] at time 03:47:07.868623
2019-09-15 03:47:07,868 [salt.state       :1813][INFO    ][3237] Executing state service.mod_watch for [ntp]
2019-09-15 03:47:07,869 [salt.loaded.int.module.cmdmod:395 ][INFO    ][3237] Executing command ['systemctl', 'is-active', 'ntp.service'] in directory '/root'
2019-09-15 03:47:07,881 [salt.loaded.int.module.cmdmod:395 ][INFO    ][3237] Executing command ['systemd-run', '--scope', 'systemctl', 'restart', 'ntp.service'] in directory '/root'
2019-09-15 03:47:07,935 [salt.state       :300 ][INFO    ][3237] {'ntp': True}
2019-09-15 03:47:07,936 [salt.state       :1951][INFO    ][3237] Completed state [ntp] at time 03:47:07.936332 duration_in_ms=67.708
2019-09-15 03:47:07,941 [salt.minion      :1711][INFO    ][3237] Returning information for job: 20190915034533616266
2019-09-15 03:47:32,964 [salt.minion      :1308][INFO    ][3138] User sudo_ubuntu Executing command ssh.set_auth_key with jid 20190915034732946926
2019-09-15 03:47:32,981 [salt.minion      :1432][INFO    ][6783] Starting a new job with PID 6783
2019-09-15 03:47:32,997 [salt.minion      :1711][INFO    ][6783] Returning information for job: 20190915034732946926
2019-09-15 03:47:33,652 [salt.minion      :1308][INFO    ][3138] User sudo_ubuntu Executing command cmd.run with jid 20190915034733634460
2019-09-15 03:47:33,668 [salt.minion      :1432][INFO    ][6788] Starting a new job with PID 6788
2019-09-15 03:47:33,677 [salt.loader.192.168.11.2.int.module.cmdmod:395 ][INFO    ][6788] Executing command 'reboot' in directory '/root'
2019-09-15 03:47:33,787 [salt.utils.parsers:1051][WARNING ][3138] Minion received a SIGTERM. Exiting.
2019-09-15 03:47:33,789 [salt.cli.daemons :82  ][INFO    ][3138] Shutting down the Salt Minion
2019-09-15 03:47:36,311 [salt.minion      :1711][INFO    ][6788] Returning information for job: 20190915034733634460
2019-09-15 03:48:39,899 [salt.cli.daemons :293 ][INFO    ][1753] Setting up the Salt Minion "odl01.mcp-odl-ha.local"
2019-09-15 03:48:43,358 [salt.cli.daemons :82  ][INFO    ][1753] Starting up the Salt Minion
2019-09-15 03:48:43,359 [salt.utils.event :1017][INFO    ][1753] Starting pull socket on /var/run/salt/minion/minion_event_7b9c575c4c_pull.ipc
2019-09-15 03:48:48,756 [salt.minion      :976 ][INFO    ][1753] Creating minion process manager
2019-09-15 03:48:51,298 [salt.loader.192.168.11.2.int.module.cmdmod:395 ][INFO    ][1753] Executing command ['date', '+%z'] in directory '/root'
2019-09-15 03:48:51,648 [salt.utils.schedule:568 ][INFO    ][1753] Updating job settings for scheduled job: __mine_interval
2019-09-15 03:48:51,650 [salt.minion      :1108][INFO    ][1753] Added mine.update to scheduler
2019-09-15 03:48:51,664 [salt.minion      :1975][INFO    ][1753] Minion is starting as user 'root'
2019-09-15 03:48:51,678 [salt.minion      :2336][INFO    ][1753] Minion is ready to receive requests!
2019-09-15 03:49:14,953 [salt.minion      :1308][INFO    ][1753] User sudo_ubuntu Executing command test.ping with jid 20190915034914941926
2019-09-15 03:49:14,964 [salt.minion      :1432][INFO    ][1845] Starting a new job with PID 1845
2019-09-15 03:49:15,062 [salt.minion      :1711][INFO    ][1845] Returning information for job: 20190915034914941926
2019-09-15 03:49:16,011 [salt.minion      :1308][INFO    ][1753] User sudo_ubuntu Executing command pkg.upgrade with jid 20190915034915999301
2019-09-15 03:49:16,024 [salt.minion      :1432][INFO    ][1850] Starting a new job with PID 1850
2019-09-15 03:49:16,585 [salt.loader.192.168.11.2.int.module.cmdmod:395 ][INFO    ][1850] Executing command ['dpkg-query', '--showformat', '${Status} ${Package} ${Version} ${Architecture}', '-W'] in directory '/root'
2019-09-15 03:49:18,553 [salt.loader.192.168.11.2.int.module.cmdmod:395 ][INFO    ][1850] Executing command ['systemd-run', '--scope', 'apt-get', '-q', '-y', '-o', 'DPkg::Options::=--force-confold', '-o', 'DPkg::Options::=--force-confdef', 'dist-upgrade'] in directory '/root'
2019-09-15 03:49:30,631 [salt.loader.192.168.11.2.int.module.cmdmod:395 ][INFO    ][1850] Executing command ['dpkg-query', '--showformat', '${Status} ${Package} ${Version} ${Architecture}', '-W'] in directory '/root'
2019-09-15 03:49:30,656 [salt.minion      :1711][INFO    ][1850] Returning information for job: 20190915034915999301
2019-09-15 03:52:28,261 [salt.minion      :1308][INFO    ][1753] User sudo_ubuntu Executing command state.sls with jid 20190915035228258211
2019-09-15 03:52:28,272 [salt.minion      :1432][INFO    ][1947] Starting a new job with PID 1947
2019-09-15 03:52:32,107 [salt.state       :915 ][INFO    ][1947] Loading fresh modules for state activity
2019-09-15 03:52:32,190 [salt.fileclient  :1219][INFO    ][1947] Fetching file from saltenv 'base', ** done ** 'opendaylight/init.sls'
2019-09-15 03:52:32,213 [salt.fileclient  :1219][INFO    ][1947] Fetching file from saltenv 'base', ** done ** 'opendaylight/server.sls'
2019-09-15 03:52:32,232 [salt.fileclient  :1219][INFO    ][1947] Fetching file from saltenv 'base', ** done ** 'opendaylight/map.jinja'
2019-09-15 03:52:32,277 [salt.fileclient  :1219][INFO    ][1947] Fetching file from saltenv 'base', ** done ** 'opendaylight/config.sls'
2019-09-15 03:52:32,321 [salt.fileclient  :1219][INFO    ][1947] Fetching file from saltenv 'base', ** done ** 'opendaylight/repo.sls'
2019-09-15 03:52:34,249 [salt.state       :1780][INFO    ][1947] Running state [cat <<-EOF | sudo apt-key add -
-----BEGIN PGP PUBLIC KEY BLOCK-----
Version: GnuPG v1

mQINBFiKaBEBEADpCtIj8utf/bUfN6iQ+sxGiOPLnXVYoYyKifHDazD4o1Jevfiu
EpcDIx9EdnhrCpvKTU+jaw2B7K3pkdqbjbzjZY+2CDENSQXfRHuuI/nWDaYI0stx
Tf/evip3cxdutnZNAklzkxppHP+4UZm9HAd7uZsEyff4H9DIsHzZIA4Z++Hx2+lt
w9K0iCKh2k6Pon/VVo8Bir3JuKIIdLRAuHmyniYlHDswQnu+1nQHE0F/oboD0Q9Z
hOvXAr1L7LWu0hkLV7BqmeI0SPcRA3b5MU3dfaTK8MaPAo8anQTpCyYUnoIBqX8h
y324T/dvpFKq2/X3RL+wOSYTA8TLgyhH0fhdIKZg3G8m9kxuAHZYHIHnDtvgJ5yd
72tNY+w8UIX8U2ark/WdkAMZr3O0AuTDlvHcasxO5+puAu8jh0EgtqItqrvKwiF7
dmlHVW41Rt+su2fmsUkk4Z0IhWrn3PdrSWAcH2eL6vjuqx6CccpjsjyiSQ90dUox
EoMpY+viX59aF0kU4BLt76mQO6YZtCpicLxFGCu97v1mNn+FWjhBOIF08pVsbNlq
oMl2j0N8NKZxJvkkmsA/i//ch5FsjzvUy3xajlSzq9ruWS4SlWq2Vzdx/acvF7Oa
ABA11wIjzLc9vmhzQNiRa53fJQwi+w/Or9LtH2msKCbcPVHoZ5OT4t6S8QARAQAB
tBpMYXVuY2hwYWQgUFBBIGZvciBPREwgVGVhbYkCOAQTAQIAIgUCWIpoEQIbAwYL
CQgHAwIGFQgCCQoLBBYCAwECHgECF4AACgkQe4qho0TAUkgAmg//XY/RqU4WcT+p
13oDc3+Dp4aL+rwaNz0o56i0z0cYPxd8GPicCuS8d/di07GnQiBcZ5DZgegnnaYm
OUF+phxk4q+jYO/t2GHQlYSf/QyUv7OimidLOHN1FiahmcGobliwih70o6ZcMT84
ggSu8jBzA/HLFBIkgStKD/staR5zJ2HfK298yVhiffyrPA+I3nPe7pvTaGa2e8AP
BYs5zB5n27upSZIokXFvqlmS4HEKDmPcY061wgmg1cNY1Y+mIuGjxY1Igbi6kAe0
yaLN2AN4c2ImhpwOcuazKTe/q2ZhoPTpYvuzmogwau8LBjRBhVS6fkTpSBPEkcwn
f/QYmmVLygmpMDHuHapyH8iaUoksq7gd64iBRDJQN7giQSjkTVvcGBqoKG8lbUMV
MDT4FGuYYsObWUg7kmHlNq9nIVlAxmxv8ZTg9+8xy3f53aId/51m+gW9LGRAT94T
ZIWrF9cBvsPWoHgHkV1At/fPprOvNXqeQiJ7UzC3ikDNCu2AjPEbA4sb019RNgtj
jUI6g6RZdzbeKVpptxILCtT3yKbfKj8AfrfaRzS0yMhVudgLolIUA4S6g46p0Cgy
gITO49wxxBu6UAOsAG3psDRlsZmmrT4AH09Yt2RzmY0FBWValqpoPagheQqeU+2W
FKnV9Lw1SKMtWZbYMvIlB0rwts3k9lE=
=xkZ9
-----END PGP PUBLIC KEY BLOCK-----
EOF] at time 03:52:34.249287
2019-09-15 03:52:34,249 [salt.state       :1813][INFO    ][1947] Executing state cmd.run for [cat <<-EOF | sudo apt-key add -
-----BEGIN PGP PUBLIC KEY BLOCK-----
Version: GnuPG v1

mQINBFiKaBEBEADpCtIj8utf/bUfN6iQ+sxGiOPLnXVYoYyKifHDazD4o1Jevfiu
EpcDIx9EdnhrCpvKTU+jaw2B7K3pkdqbjbzjZY+2CDENSQXfRHuuI/nWDaYI0stx
Tf/evip3cxdutnZNAklzkxppHP+4UZm9HAd7uZsEyff4H9DIsHzZIA4Z++Hx2+lt
w9K0iCKh2k6Pon/VVo8Bir3JuKIIdLRAuHmyniYlHDswQnu+1nQHE0F/oboD0Q9Z
hOvXAr1L7LWu0hkLV7BqmeI0SPcRA3b5MU3dfaTK8MaPAo8anQTpCyYUnoIBqX8h
y324T/dvpFKq2/X3RL+wOSYTA8TLgyhH0fhdIKZg3G8m9kxuAHZYHIHnDtvgJ5yd
72tNY+w8UIX8U2ark/WdkAMZr3O0AuTDlvHcasxO5+puAu8jh0EgtqItqrvKwiF7
dmlHVW41Rt+su2fmsUkk4Z0IhWrn3PdrSWAcH2eL6vjuqx6CccpjsjyiSQ90dUox
EoMpY+viX59aF0kU4BLt76mQO6YZtCpicLxFGCu97v1mNn+FWjhBOIF08pVsbNlq
oMl2j0N8NKZxJvkkmsA/i//ch5FsjzvUy3xajlSzq9ruWS4SlWq2Vzdx/acvF7Oa
ABA11wIjzLc9vmhzQNiRa53fJQwi+w/Or9LtH2msKCbcPVHoZ5OT4t6S8QARAQAB
tBpMYXVuY2hwYWQgUFBBIGZvciBPREwgVGVhbYkCOAQTAQIAIgUCWIpoEQIbAwYL
CQgHAwIGFQgCCQoLBBYCAwECHgECF4AACgkQe4qho0TAUkgAmg//XY/RqU4WcT+p
13oDc3+Dp4aL+rwaNz0o56i0z0cYPxd8GPicCuS8d/di07GnQiBcZ5DZgegnnaYm
OUF+phxk4q+jYO/t2GHQlYSf/QyUv7OimidLOHN1FiahmcGobliwih70o6ZcMT84
ggSu8jBzA/HLFBIkgStKD/staR5zJ2HfK298yVhiffyrPA+I3nPe7pvTaGa2e8AP
BYs5zB5n27upSZIokXFvqlmS4HEKDmPcY061wgmg1cNY1Y+mIuGjxY1Igbi6kAe0
yaLN2AN4c2ImhpwOcuazKTe/q2ZhoPTpYvuzmogwau8LBjRBhVS6fkTpSBPEkcwn
f/QYmmVLygmpMDHuHapyH8iaUoksq7gd64iBRDJQN7giQSjkTVvcGBqoKG8lbUMV
MDT4FGuYYsObWUg7kmHlNq9nIVlAxmxv8ZTg9+8xy3f53aId/51m+gW9LGRAT94T
ZIWrF9cBvsPWoHgHkV1At/fPprOvNXqeQiJ7UzC3ikDNCu2AjPEbA4sb019RNgtj
jUI6g6RZdzbeKVpptxILCtT3yKbfKj8AfrfaRzS0yMhVudgLolIUA4S6g46p0Cgy
gITO49wxxBu6UAOsAG3psDRlsZmmrT4AH09Yt2RzmY0FBWValqpoPagheQqeU+2W
FKnV9Lw1SKMtWZbYMvIlB0rwts3k9lE=
=xkZ9
-----END PGP PUBLIC KEY BLOCK-----
EOF]
2019-09-15 03:52:34,250 [salt.loaded.int.module.cmdmod:395 ][INFO    ][1947] Executing command 'apt-key list | grep -qF '4096R/44C05248 2017-01-26'' in directory '/root'
2019-09-15 03:52:34,354 [salt.loaded.int.module.cmdmod:395 ][INFO    ][1947] Executing command 'cat <<-EOF | sudo apt-key add -
-----BEGIN PGP PUBLIC KEY BLOCK-----
Version: GnuPG v1

mQINBFiKaBEBEADpCtIj8utf/bUfN6iQ+sxGiOPLnXVYoYyKifHDazD4o1Jevfiu
EpcDIx9EdnhrCpvKTU+jaw2B7K3pkdqbjbzjZY+2CDENSQXfRHuuI/nWDaYI0stx
Tf/evip3cxdutnZNAklzkxppHP+4UZm9HAd7uZsEyff4H9DIsHzZIA4Z++Hx2+lt
w9K0iCKh2k6Pon/VVo8Bir3JuKIIdLRAuHmyniYlHDswQnu+1nQHE0F/oboD0Q9Z
hOvXAr1L7LWu0hkLV7BqmeI0SPcRA3b5MU3dfaTK8MaPAo8anQTpCyYUnoIBqX8h
y324T/dvpFKq2/X3RL+wOSYTA8TLgyhH0fhdIKZg3G8m9kxuAHZYHIHnDtvgJ5yd
72tNY+w8UIX8U2ark/WdkAMZr3O0AuTDlvHcasxO5+puAu8jh0EgtqItqrvKwiF7
dmlHVW41Rt+su2fmsUkk4Z0IhWrn3PdrSWAcH2eL6vjuqx6CccpjsjyiSQ90dUox
EoMpY+viX59aF0kU4BLt76mQO6YZtCpicLxFGCu97v1mNn+FWjhBOIF08pVsbNlq
oMl2j0N8NKZxJvkkmsA/i//ch5FsjzvUy3xajlSzq9ruWS4SlWq2Vzdx/acvF7Oa
ABA11wIjzLc9vmhzQNiRa53fJQwi+w/Or9LtH2msKCbcPVHoZ5OT4t6S8QARAQAB
tBpMYXVuY2hwYWQgUFBBIGZvciBPREwgVGVhbYkCOAQTAQIAIgUCWIpoEQIbAwYL
CQgHAwIGFQgCCQoLBBYCAwECHgECF4AACgkQe4qho0TAUkgAmg//XY/RqU4WcT+p
13oDc3+Dp4aL+rwaNz0o56i0z0cYPxd8GPicCuS8d/di07GnQiBcZ5DZgegnnaYm
OUF+phxk4q+jYO/t2GHQlYSf/QyUv7OimidLOHN1FiahmcGobliwih70o6ZcMT84
ggSu8jBzA/HLFBIkgStKD/staR5zJ2HfK298yVhiffyrPA+I3nPe7pvTaGa2e8AP
BYs5zB5n27upSZIokXFvqlmS4HEKDmPcY061wgmg1cNY1Y+mIuGjxY1Igbi6kAe0
yaLN2AN4c2ImhpwOcuazKTe/q2ZhoPTpYvuzmogwau8LBjRBhVS6fkTpSBPEkcwn
f/QYmmVLygmpMDHuHapyH8iaUoksq7gd64iBRDJQN7giQSjkTVvcGBqoKG8lbUMV
MDT4FGuYYsObWUg7kmHlNq9nIVlAxmxv8ZTg9+8xy3f53aId/51m+gW9LGRAT94T
ZIWrF9cBvsPWoHgHkV1At/fPprOvNXqeQiJ7UzC3ikDNCu2AjPEbA4sb019RNgtj
jUI6g6RZdzbeKVpptxILCtT3yKbfKj8AfrfaRzS0yMhVudgLolIUA4S6g46p0Cgy
gITO49wxxBu6UAOsAG3psDRlsZmmrT4AH09Yt2RzmY0FBWValqpoPagheQqeU+2W
FKnV9Lw1SKMtWZbYMvIlB0rwts3k9lE=
=xkZ9
-----END PGP PUBLIC KEY BLOCK-----
EOF' in directory '/root'
2019-09-15 03:52:34,593 [salt.state       :300 ][INFO    ][1947] {'pid': 2009, 'retcode': 0, 'stderr': '', 'stdout': 'OK'}
2019-09-15 03:52:34,594 [salt.state       :1951][INFO    ][1947] Completed state [cat <<-EOF | sudo apt-key add -
-----BEGIN PGP PUBLIC KEY BLOCK-----
Version: GnuPG v1

mQINBFiKaBEBEADpCtIj8utf/bUfN6iQ+sxGiOPLnXVYoYyKifHDazD4o1Jevfiu
EpcDIx9EdnhrCpvKTU+jaw2B7K3pkdqbjbzjZY+2CDENSQXfRHuuI/nWDaYI0stx
Tf/evip3cxdutnZNAklzkxppHP+4UZm9HAd7uZsEyff4H9DIsHzZIA4Z++Hx2+lt
w9K0iCKh2k6Pon/VVo8Bir3JuKIIdLRAuHmyniYlHDswQnu+1nQHE0F/oboD0Q9Z
hOvXAr1L7LWu0hkLV7BqmeI0SPcRA3b5MU3dfaTK8MaPAo8anQTpCyYUnoIBqX8h
y324T/dvpFKq2/X3RL+wOSYTA8TLgyhH0fhdIKZg3G8m9kxuAHZYHIHnDtvgJ5yd
72tNY+w8UIX8U2ark/WdkAMZr3O0AuTDlvHcasxO5+puAu8jh0EgtqItqrvKwiF7
dmlHVW41Rt+su2fmsUkk4Z0IhWrn3PdrSWAcH2eL6vjuqx6CccpjsjyiSQ90dUox
EoMpY+viX59aF0kU4BLt76mQO6YZtCpicLxFGCu97v1mNn+FWjhBOIF08pVsbNlq
oMl2j0N8NKZxJvkkmsA/i//ch5FsjzvUy3xajlSzq9ruWS4SlWq2Vzdx/acvF7Oa
ABA11wIjzLc9vmhzQNiRa53fJQwi+w/Or9LtH2msKCbcPVHoZ5OT4t6S8QARAQAB
tBpMYXVuY2hwYWQgUFBBIGZvciBPREwgVGVhbYkCOAQTAQIAIgUCWIpoEQIbAwYL
CQgHAwIGFQgCCQoLBBYCAwECHgECF4AACgkQe4qho0TAUkgAmg//XY/RqU4WcT+p
13oDc3+Dp4aL+rwaNz0o56i0z0cYPxd8GPicCuS8d/di07GnQiBcZ5DZgegnnaYm
OUF+phxk4q+jYO/t2GHQlYSf/QyUv7OimidLOHN1FiahmcGobliwih70o6ZcMT84
ggSu8jBzA/HLFBIkgStKD/staR5zJ2HfK298yVhiffyrPA+I3nPe7pvTaGa2e8AP
BYs5zB5n27upSZIokXFvqlmS4HEKDmPcY061wgmg1cNY1Y+mIuGjxY1Igbi6kAe0
yaLN2AN4c2ImhpwOcuazKTe/q2ZhoPTpYvuzmogwau8LBjRBhVS6fkTpSBPEkcwn
f/QYmmVLygmpMDHuHapyH8iaUoksq7gd64iBRDJQN7giQSjkTVvcGBqoKG8lbUMV
MDT4FGuYYsObWUg7kmHlNq9nIVlAxmxv8ZTg9+8xy3f53aId/51m+gW9LGRAT94T
ZIWrF9cBvsPWoHgHkV1At/fPprOvNXqeQiJ7UzC3ikDNCu2AjPEbA4sb019RNgtj
jUI6g6RZdzbeKVpptxILCtT3yKbfKj8AfrfaRzS0yMhVudgLolIUA4S6g46p0Cgy
gITO49wxxBu6UAOsAG3psDRlsZmmrT4AH09Yt2RzmY0FBWValqpoPagheQqeU+2W
FKnV9Lw1SKMtWZbYMvIlB0rwts3k9lE=
=xkZ9
-----END PGP PUBLIC KEY BLOCK-----
EOF] at time 03:52:34.594250 duration_in_ms=344.964
2019-09-15 03:52:34,604 [salt.state       :1780][INFO    ][1947] Running state [deb http://ppa.launchpad.net/odl-team/fluorine/ubuntu xenial main] at time 03:52:34.604524
2019-09-15 03:52:34,604 [salt.state       :1813][INFO    ][1947] Executing state pkgrepo.managed for [deb http://ppa.launchpad.net/odl-team/fluorine/ubuntu xenial main]
2019-09-15 03:52:34,687 [salt.loaded.int.module.cmdmod:395 ][INFO    ][1947] Executing command ['apt-get', '-q', 'update'] in directory '/root'
2019-09-15 03:52:39,167 [salt.state       :300 ][INFO    ][1947] {'repo': 'deb http://ppa.launchpad.net/odl-team/fluorine/ubuntu xenial main'}
2019-09-15 03:52:39,168 [salt.state       :1951][INFO    ][1947] Completed state [deb http://ppa.launchpad.net/odl-team/fluorine/ubuntu xenial main] at time 03:52:39.168077 duration_in_ms=4563.55
2019-09-15 03:52:39,270 [salt.state       :1780][INFO    ][1947] Running state [opendaylight] at time 03:52:39.270246
2019-09-15 03:52:39,346 [salt.loaded.int.module.cmdmod:395 ][INFO    ][1947] Executing command ['dpkg-query', '--showformat', '${Status} ${Package} ${Version} ${Architecture}', '-W'] in directory '/root'
2019-09-15 03:52:39,664 [salt.state       :1780][INFO    ][1947] Running state [opendaylight] at time 03:52:39.664531
2019-09-15 03:52:39,665 [salt.state       :1813][INFO    ][1947] Executing state service.masked for [opendaylight]
2019-09-15 03:52:39,666 [salt.loaded.int.module.cmdmod:395 ][INFO    ][1947] Executing command ['systemctl', 'status', 'opendaylight.service', '-n', '0'] in directory '/root'
2019-09-15 03:52:39,688 [salt.loaded.int.module.cmdmod:395 ][INFO    ][1947] Executing command ['systemd-run', '--scope', 'systemctl', 'mask', 'opendaylight.service'] in directory '/root'
2019-09-15 03:52:39,778 [salt.state       :300 ][INFO    ][1947] Made the following changes:
'masked' changed from 'False' to 'True'

2019-09-15 03:52:39,778 [salt.state       :1951][INFO    ][1947] Completed state [opendaylight] at time 03:52:39.778573 duration_in_ms=114.042
2019-09-15 03:52:39,779 [salt.state       :1780][INFO    ][1947] Running state [opendaylight] at time 03:52:39.779129
2019-09-15 03:52:39,779 [salt.state       :1813][INFO    ][1947] Executing state pkg.installed for [opendaylight]
2019-09-15 03:52:39,794 [salt.loaded.int.module.cmdmod:395 ][INFO    ][1947] Executing command ['dpkg', '--get-selections', '*'] in directory '/root'
2019-09-15 03:52:39,812 [salt.loaded.int.module.cmdmod:395 ][INFO    ][1947] Executing command ['systemd-run', '--scope', 'apt-get', '-q', '-y', '-o', 'DPkg::Options::=--force-confold', '-o', 'DPkg::Options::=--force-confdef', 'install', 'opendaylight'] in directory '/root'
2019-09-15 03:52:43,383 [salt.minion      :1308][INFO    ][1753] User sudo_ubuntu Executing command saltutil.find_job with jid 20190915035243377626
2019-09-15 03:52:43,397 [salt.minion      :1432][INFO    ][2498] Starting a new job with PID 2498
2019-09-15 03:52:43,415 [salt.minion      :1711][INFO    ][2498] Returning information for job: 20190915035243377626
2019-09-15 03:53:13,409 [salt.minion      :1308][INFO    ][1753] User sudo_ubuntu Executing command saltutil.find_job with jid 20190915035313404442
2019-09-15 03:53:13,419 [salt.minion      :1432][INFO    ][2724] Starting a new job with PID 2724
2019-09-15 03:53:13,432 [salt.minion      :1711][INFO    ][2724] Returning information for job: 20190915035313404442
2019-09-15 03:53:27,218 [salt.loaded.int.module.cmdmod:395 ][INFO    ][1947] Executing command ['dpkg-query', '--showformat', '${Status} ${Package} ${Version} ${Architecture}', '-W'] in directory '/root'
2019-09-15 03:53:27,245 [salt.state       :300 ][INFO    ][1947] Made the following changes:
'java-common' changed from 'absent' to '0.56ubuntu2'
'libxtst6' changed from 'absent' to '2:1.2.2-1'
'liblcms2-2' changed from 'absent' to '2.6-3ubuntu2.1'
'openjdk-8-jre-headless' changed from 'absent' to '8u222-b10-1ubuntu1~16.04.1'
'libxrender1' changed from 'absent' to '1:0.9.9-0ubuntu1'
'libavahi-common3' changed from 'absent' to '0.6.32~rc+dfsg-1ubuntu2.3'
'libnspr4' changed from 'absent' to '2:4.13.1-0ubuntu0.16.04.1'
'libfontconfig' changed from 'absent' to '1'
'fonts-dejavu-core' changed from 'absent' to '2.35-1'
'libnss3-nssdb' changed from 'absent' to '2:3.28.4-0ubuntu0.16.04.6'
'java8-runtime-headless' changed from 'absent' to '1'
'libcups2' changed from 'absent' to '2.1.3-4ubuntu0.10'
'libjpeg-turbo8' changed from 'absent' to '1.4.2-0ubuntu3.1'
'libavahi-client3' changed from 'absent' to '0.6.32~rc+dfsg-1ubuntu2.3'
'libnss3' changed from 'absent' to '2:3.28.4-0ubuntu0.16.04.6'
'libpcsclite1' changed from 'absent' to '1.8.14-1ubuntu1.16.04.1'
'java7-runtime-headless' changed from 'absent' to '1'
'ca-certificates-java' changed from 'absent' to '20160321ubuntu1'
'java2-runtime-headless' changed from 'absent' to '1'
'fontconfig-config' changed from 'absent' to '2.11.94-0ubuntu1.1'
'libavahi-common-data' changed from 'absent' to '0.6.32~rc+dfsg-1ubuntu2.3'
'libxi6' changed from 'absent' to '2:1.7.6-1'
'java5-runtime-headless' changed from 'absent' to '1'
'java6-runtime-headless' changed from 'absent' to '1'
'x11-common' changed from 'absent' to '1:7.7+13ubuntu3.1'
'libjpeg8' changed from 'absent' to '8c-2ubuntu8'
'opendaylight' changed from 'absent' to '9.0.0-1ppa2'
'libfontconfig1' changed from 'absent' to '2.11.94-0ubuntu1.1'

2019-09-15 03:53:27,286 [salt.state       :915 ][INFO    ][1947] Loading fresh modules for state activity
2019-09-15 03:53:27,312 [salt.state       :1951][INFO    ][1947] Completed state [opendaylight] at time 03:53:27.312110 duration_in_ms=47532.98
2019-09-15 03:53:27,315 [salt.state       :1780][INFO    ][1947] Running state [/opt/opendaylight/etc/jetty.xml] at time 03:53:27.314984
2019-09-15 03:53:27,315 [salt.state       :1813][INFO    ][1947] Executing state file.managed for [/opt/opendaylight/etc/jetty.xml]
2019-09-15 03:53:27,337 [salt.fileclient  :1219][INFO    ][1947] Fetching file from saltenv 'base', ** done ** 'opendaylight/files/jetty.xml'
2019-09-15 03:53:27,360 [salt.state       :300 ][INFO    ][1947] File changed:
--- 
+++ 
@@ -79,11 +79,11 @@
                         </Item>
                     </Array>
                 </Arg>
-                <Set name="host">
+                <Set name="host">10.167.4.40
                     <Property name="jetty.host"/>
                 </Set>
                 <Set name="port">
-                    <Property name="jetty.port" default="8181"/>
+                    <Property name="jetty.port" default="8282"/>
                 </Set>
                 <Set name="idleTimeout">
                     <Property name="http.timeout" default="300000"/>

2019-09-15 03:53:27,360 [salt.state       :1951][INFO    ][1947] Completed state [/opt/opendaylight/etc/jetty.xml] at time 03:53:27.360900 duration_in_ms=45.916
2019-09-15 03:53:27,361 [salt.state       :1780][INFO    ][1947] Running state [/opt/opendaylight/bin/setenv] at time 03:53:27.361180
2019-09-15 03:53:27,361 [salt.state       :1813][INFO    ][1947] Executing state file.managed for [/opt/opendaylight/bin/setenv]
2019-09-15 03:53:27,376 [salt.fileclient  :1219][INFO    ][1947] Fetching file from saltenv 'base', ** done ** 'opendaylight/files/setenv.shell'
2019-09-15 03:53:27,392 [salt.state       :300 ][INFO    ][1947] File changed:
--- 
+++ 
@@ -1,55 +1,19 @@
-#!/bin/sh
-#
-#    Licensed to the Apache Software Foundation (ASF) under one or more
-#    contributor license agreements.  See the NOTICE file distributed with
-#    this work for additional information regarding copyright ownership.
-#    The ASF licenses this file to You under the Apache License, Version 2.0
-#    (the "License"); you may not use this file except in compliance with
-#    the License.  You may obtain a copy of the License at
-#
-#       http://www.apache.org/licenses/LICENSE-2.0
-#
-#    Unless required by applicable law or agreed to in writing, software
-#    distributed under the License is distributed on an "AS IS" BASIS,
-#    WITHOUT WARRANTIES OR CONDITIONS OF ANY KIND, either express or implied.
-#    See the License for the specific language governing permissions and
-#    limitations under the License.
-#
-
-#
-# handle specific scripts; the SCRIPT_NAME is exactly the name of the Karaf
-# script: client, instance, shell, start, status, stop, karaf
-#
-# if [ "${KARAF_SCRIPT}" == "SCRIPT_NAME" ]; then
-#   Actions go here...
-# fi
-
-#
-# general settings which should be applied for all scripts go here; please keep
-# in mind that it is possible that scripts might be executed more than once, e.g.
-# in example of the start script where the start script is executed first and the
-# karaf script afterwards.
-#
-
-#
-# The following section shows the possible configuration options for the default 
-# karaf scripts
-#
-# export JAVA_HOME # Location of Java installation
-# export JAVA_MIN_MEM # Minimum memory for the JVM
-# export JAVA_MAX_MEM # Maximum memory for the JVM
+##############################################################################
+# Copyright (c) 2017 Mirantis Inc. and others.
+# All rights reserved. This program and the accompanying materials
+# are made available under the terms of the Apache License, Version 2.0
+# which accompanies this distribution, and is available at
+# http://www.apache.org/licenses/LICENSE-2.0
+############################################################################### export JAVA_HOME # Location of Java installation
+export JAVA_MIN_MEM=6g # Minimum memory for the JVM
+export JAVA_MAX_MEM=6g # Maximum memory for the JVM
 # export JAVA_PERM_MEM # Minimum perm memory for the JVM
-# export JAVA_MAX_PERM_MEM # Maximum perm memory for the JVM
-# export EXTRA_JAVA_OPTS # Additional JVM options
+export JAVA_MAX_PERM_MEM=512m # Maximum perm memory for the JVM
+export EXTRA_JAVA_OPTS='-Djava.net.preferIPv4Stack=true -XX:+UseG1GC' # Additional JVM options
 # export KARAF_HOME # Karaf home folder
 # export KARAF_DATA # Karaf data folder
 # export KARAF_BASE # Karaf base folder
 # export KARAF_ETC  # Karaf etc  folder
-# export KARAF_SYSTEM_OPTS # First citizen Karaf options
 # export KARAF_OPTS # Additional available Karaf options
 # export KARAF_DEBUG # Enable debug mode
 # export KARAF_REDIRECT # Enable/set the std/err redirection when using bin/start
-# export KARAF_NOROOT # Prevent execution as root if set to true
-if [ "x$JAVA_MAX_MEM" = "x" ]; then
-    export JAVA_MAX_MEM="2048m"
-fi

2019-09-15 03:53:27,395 [salt.state       :1951][INFO    ][1947] Completed state [/opt/opendaylight/bin/setenv] at time 03:53:27.395886 duration_in_ms=34.706
2019-09-15 03:53:27,407 [salt.state       :1780][INFO    ][1947] Running state [/opt/opendaylight/etc/org.apache.karaf.features.cfg] at time 03:53:27.407469
2019-09-15 03:53:27,407 [salt.state       :1813][INFO    ][1947] Executing state ini.options_present for [/opt/opendaylight/etc/org.apache.karaf.features.cfg]
2019-09-15 03:53:27,420 [salt.state       :300 ][INFO    ][1947] {'featuresBoot': {'after': 'standard,wrap,ssh,odl-restconf-all,odl-aaa-authn,odl-netvirt-openstack', 'before': 'c356856b-baa8-4437-a4b1-6f6fb032f029'}}
2019-09-15 03:53:27,420 [salt.state       :1951][INFO    ][1947] Completed state [/opt/opendaylight/etc/org.apache.karaf.features.cfg] at time 03:53:27.420581 duration_in_ms=13.113
2019-09-15 03:53:27,420 [salt.state       :1780][INFO    ][1947] Running state [/opt/opendaylight/etc/org.ops4j.pax.web.cfg] at time 03:53:27.420806
2019-09-15 03:53:27,420 [salt.state       :1813][INFO    ][1947] Executing state ini.options_present for [/opt/opendaylight/etc/org.ops4j.pax.web.cfg]
2019-09-15 03:53:27,425 [salt.state       :300 ][INFO    ][1947] {'org.osgi.service.http.port': {'after': '8282', 'before': '8181'}, 'org.ops4j.pax.web.listening.addresses': {'after': '10.167.4.40', 'before': None}}
2019-09-15 03:53:27,425 [salt.state       :1951][INFO    ][1947] Completed state [/opt/opendaylight/etc/org.ops4j.pax.web.cfg] at time 03:53:27.425726 duration_in_ms=4.92
2019-09-15 03:53:27,425 [salt.state       :1780][INFO    ][1947] Running state [/opt/opendaylight/etc/org.ops4j.pax.logging.cfg] at time 03:53:27.425957
2019-09-15 03:53:27,426 [salt.state       :1813][INFO    ][1947] Executing state file.comment for [/opt/opendaylight/etc/org.ops4j.pax.logging.cfg]
2019-09-15 03:53:27,430 [salt.state       :300 ][INFO    ][1947] File changed:
--- 
+++ 
@@ -26,7 +26,7 @@
 #log4j2.rootLogger.type = asyncRoot
 #log4j2.rootLogger.includeLocation = false
 log4j2.rootLogger.appenderRef.RollingFile.ref = RollingFile
-log4j2.rootLogger.appenderRef.PaxOsgi.ref = PaxOsgi
+#log4j2.rootLogger.appenderRef.PaxOsgi.ref = PaxOsgi
 log4j2.rootLogger.appenderRef.Console.ref = Console
 log4j2.rootLogger.appenderRef.Console.filter.threshold.type = ThresholdFilter
 log4j2.rootLogger.appenderRef.Console.filter.threshold.level = ${karaf.log.console:-OFF}

2019-09-15 03:53:27,430 [salt.state       :1951][INFO    ][1947] Completed state [/opt/opendaylight/etc/org.ops4j.pax.logging.cfg] at time 03:53:27.430356 duration_in_ms=4.399
2019-09-15 03:53:27,430 [salt.state       :1780][INFO    ][1947] Running state [/opt/opendaylight/etc/org.ops4j.pax.logging.cfg] at time 03:53:27.430592
2019-09-15 03:53:27,430 [salt.state       :1813][INFO    ][1947] Executing state file.comment for [/opt/opendaylight/etc/org.ops4j.pax.logging.cfg]
2019-09-15 03:53:27,439 [salt.state       :300 ][INFO    ][1947] File changed:
--- 
+++ 
@@ -78,7 +78,7 @@
 log4j2.appender.audit.policies.size.size = 8MB
 
 # OSGi appender
-log4j2.appender.osgi.type = PaxOsgi
+#log4j2.appender.osgi.type = PaxOsgi
 log4j2.appender.osgi.name = PaxOsgi
 log4j2.appender.osgi.filter = *
 

2019-09-15 03:53:27,439 [salt.state       :1951][INFO    ][1947] Completed state [/opt/opendaylight/etc/org.ops4j.pax.logging.cfg] at time 03:53:27.439803 duration_in_ms=9.211
2019-09-15 03:53:27,440 [salt.state       :1780][INFO    ][1947] Running state [/opt/opendaylight/etc/org.ops4j.pax.logging.cfg] at time 03:53:27.440045
2019-09-15 03:53:27,440 [salt.state       :1813][INFO    ][1947] Executing state file.comment for [/opt/opendaylight/etc/org.ops4j.pax.logging.cfg]
2019-09-15 03:53:27,445 [salt.state       :300 ][INFO    ][1947] File changed:
--- 
+++ 
@@ -79,7 +79,7 @@
 
 # OSGi appender
 #log4j2.appender.osgi.type = PaxOsgi
-log4j2.appender.osgi.name = PaxOsgi
+#log4j2.appender.osgi.name = PaxOsgi
 log4j2.appender.osgi.filter = *
 
 # help with identification of maven-related problems with pax-url-aether

2019-09-15 03:53:27,446 [salt.state       :1951][INFO    ][1947] Completed state [/opt/opendaylight/etc/org.ops4j.pax.logging.cfg] at time 03:53:27.446098 duration_in_ms=6.052
2019-09-15 03:53:27,446 [salt.state       :1780][INFO    ][1947] Running state [/opt/opendaylight/etc/org.ops4j.pax.logging.cfg] at time 03:53:27.446330
2019-09-15 03:53:27,446 [salt.state       :1813][INFO    ][1947] Executing state file.comment for [/opt/opendaylight/etc/org.ops4j.pax.logging.cfg]
2019-09-15 03:53:27,452 [salt.state       :300 ][INFO    ][1947] File changed:
--- 
+++ 
@@ -80,7 +80,7 @@
 # OSGi appender
 #log4j2.appender.osgi.type = PaxOsgi
 #log4j2.appender.osgi.name = PaxOsgi
-log4j2.appender.osgi.filter = *
+#log4j2.appender.osgi.filter = *
 
 # help with identification of maven-related problems with pax-url-aether
 #log4j2.logger.aether.name = shaded.org.eclipse.aether

2019-09-15 03:53:27,452 [salt.state       :1951][INFO    ][1947] Completed state [/opt/opendaylight/etc/org.ops4j.pax.logging.cfg] at time 03:53:27.452416 duration_in_ms=6.086
2019-09-15 03:53:27,452 [salt.state       :1780][INFO    ][1947] Running state [/opt/opendaylight/etc/org.opendaylight.openflowplugin.cfg] at time 03:53:27.452648
2019-09-15 03:53:27,452 [salt.state       :1813][INFO    ][1947] Executing state file.managed for [/opt/opendaylight/etc/org.opendaylight.openflowplugin.cfg]
2019-09-15 03:53:27,453 [salt.loaded.int.states.file:2298][WARNING ][1947] State for file: /opt/opendaylight/etc/org.opendaylight.openflowplugin.cfg - 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.
2019-09-15 03:53:27,453 [salt.state       :300 ][INFO    ][1947] {'new': 'file /opt/opendaylight/etc/org.opendaylight.openflowplugin.cfg created', 'group': 'odl', 'user': 'odl'}
2019-09-15 03:53:27,453 [salt.state       :1951][INFO    ][1947] Completed state [/opt/opendaylight/etc/org.opendaylight.openflowplugin.cfg] at time 03:53:27.453889 duration_in_ms=1.241
2019-09-15 03:53:27,454 [salt.state       :1780][INFO    ][1947] Running state [/opt/opendaylight/etc/org.opendaylight.openflowplugin.cfg] at time 03:53:27.454125
2019-09-15 03:53:27,454 [salt.state       :1813][INFO    ][1947] Executing state ini.options_present for [/opt/opendaylight/etc/org.opendaylight.openflowplugin.cfg]
2019-09-15 03:53:27,454 [salt.state       :300 ][INFO    ][1947] {'is-statistics-polling-on': {'after': 'False', 'before': None}}
2019-09-15 03:53:27,454 [salt.state       :1951][INFO    ][1947] Completed state [/opt/opendaylight/etc/org.opendaylight.openflowplugin.cfg] at time 03:53:27.454872 duration_in_ms=0.746
2019-09-15 03:53:27,455 [salt.state       :1780][INFO    ][1947] Running state [/opt/opendaylight/etc/custom.properties] at time 03:53:27.455099
2019-09-15 03:53:27,455 [salt.state       :1813][INFO    ][1947] Executing state ini.options_present for [/opt/opendaylight/etc/custom.properties]
2019-09-15 03:53:27,474 [salt.state       :300 ][INFO    ][1947] {'ovsdb.l3.fwd.enabled': {'after': 'yes', 'before': None}, 'ovsdb.of.version': {'after': '1.3', 'before': None}}
2019-09-15 03:53:27,474 [salt.state       :1951][INFO    ][1947] Completed state [/opt/opendaylight/etc/custom.properties] at time 03:53:27.474520 duration_in_ms=19.42
2019-09-15 03:53:27,474 [salt.state       :1780][INFO    ][1947] Running state [/opt/opendaylight/etc/opendaylight/datastore/initial/config/netvirt-natservice-config.xml] at time 03:53:27.474753
2019-09-15 03:53:27,474 [salt.state       :1813][INFO    ][1947] Executing state file.managed for [/opt/opendaylight/etc/opendaylight/datastore/initial/config/netvirt-natservice-config.xml]
2019-09-15 03:53:27,489 [salt.fileclient  :1219][INFO    ][1947] Fetching file from saltenv 'base', ** done ** 'opendaylight/files/netvirt-natservice-config.xml'
2019-09-15 03:53:27,509 [salt.state       :300 ][INFO    ][1947] File changed:
New file
2019-09-15 03:53:27,509 [salt.state       :1951][INFO    ][1947] Completed state [/opt/opendaylight/etc/opendaylight/datastore/initial/config/netvirt-natservice-config.xml] at time 03:53:27.509371 duration_in_ms=34.617
2019-09-15 03:53:27,510 [salt.state       :1780][INFO    ][1947] Running state [/opt/opendaylight/bin/configure-cluster-ipdetect.sh 10.167.4.40 10.167.4.41 10.167.4.42] at time 03:53:27.510058
2019-09-15 03:53:27,510 [salt.state       :1813][INFO    ][1947] Executing state cmd.run for [/opt/opendaylight/bin/configure-cluster-ipdetect.sh 10.167.4.40 10.167.4.41 10.167.4.42]
2019-09-15 03:53:27,512 [salt.loaded.int.module.cmdmod:395 ][INFO    ][1947] Executing command '/opt/opendaylight/bin/configure-cluster-ipdetect.sh 10.167.4.40 10.167.4.41 10.167.4.42' in directory '/root'
2019-09-15 03:53:27,567 [salt.state       :300 ][INFO    ][1947] {'pid': 5579, 'retcode': 0, 'stderr': '', 'stdout': '################################################\n##             Configure Cluster              ##\n################################################\n NOTE: Cluster configuration files not found. Copying from\n /opt/opendaylight/system/org/opendaylight/controller/sal-clustering-config/1.8.0\nConfiguring unique name in akka.conf\nConfiguring hostname in akka.conf\nConfiguring data and rpc seed nodes in akka.conf\nmodules = [\n\t\n\t{\n\t\tname = "inventory"\n\t\tnamespace = "urn:opendaylight:inventory"\n\t\tshard-strategy = "module"\n\t},\n\t{\n\t\tname = "topology"\n\t\tnamespace = "urn:TBD:params:xml:ns:yang:network-topology"\n\t\tshard-strategy = "module"\n\t},\n\t{\n\t\tname = "toaster"\n\t\tnamespace = "http://netconfcentral.org/ns/toaster"\n\t\tshard-strategy = "module"\n\t}\n]\nConfiguring replication type in module-shards.conf\n################################################\n##   NOTE: Manually restart controller to     ##\n##         apply configuration.               ##\n################################################'}
2019-09-15 03:53:27,568 [salt.state       :1951][INFO    ][1947] Completed state [/opt/opendaylight/bin/configure-cluster-ipdetect.sh 10.167.4.40 10.167.4.41 10.167.4.42] at time 03:53:27.568186 duration_in_ms=58.128
2019-09-15 03:53:27,908 [salt.state       :1780][INFO    ][1947] Running state [opendaylight] at time 03:53:27.908380
2019-09-15 03:53:27,908 [salt.state       :1813][INFO    ][1947] Executing state service.running for [opendaylight]
2019-09-15 03:53:27,909 [salt.state       :302 ][ERROR   ][1947] The named service opendaylight is not available
2019-09-15 03:53:27,909 [salt.state       :1951][INFO    ][1947] Completed state [opendaylight] at time 03:53:27.909693 duration_in_ms=1.313
2019-09-15 03:53:27,909 [salt.state       :1780][INFO    ][1947] Running state [opendaylight] at time 03:53:27.909840
2019-09-15 03:53:27,910 [salt.state       :1813][INFO    ][1947] Executing state service.mod_watch for [opendaylight]
2019-09-15 03:53:27,910 [salt.loaded.int.module.cmdmod:395 ][INFO    ][1947] Executing command ['systemctl', 'is-active', 'opendaylight.service'] in directory '/root'
2019-09-15 03:53:27,922 [salt.loaded.int.module.cmdmod:395 ][INFO    ][1947] Executing command ['systemd-run', '--scope', 'systemctl', 'stop', 'opendaylight.service'] in directory '/root'
2019-09-15 03:53:27,953 [salt.loaded.int.module.cmdmod:395 ][INFO    ][1947] Executing command ['systemd-run', '--scope', 'systemctl', 'unmask', 'opendaylight.service'] in directory '/root'
2019-09-15 03:53:28,052 [salt.loaded.int.module.cmdmod:395 ][INFO    ][1947] Executing command ['systemd-run', '--scope', 'systemctl', 'start', 'opendaylight.service'] in directory '/root'
2019-09-15 03:53:28,091 [salt.state       :300 ][INFO    ][1947] {'opendaylight': True}
2019-09-15 03:53:28,092 [salt.state       :1951][INFO    ][1947] Completed state [opendaylight] at time 03:53:28.092127 duration_in_ms=182.286
2019-09-15 03:53:28,093 [salt.minion      :1711][INFO    ][1947] Returning information for job: 20190915035228258211
2019-09-15 03:53:28,725 [salt.minion      :1308][INFO    ][1753] User sudo_ubuntu Executing command pillar.get with jid 20190915035328721338
2019-09-15 03:53:28,736 [salt.minion      :1432][INFO    ][5856] Starting a new job with PID 5856
2019-09-15 03:53:28,741 [salt.minion      :1711][INFO    ][5856] Returning information for job: 20190915035328721338
2019-09-15 03:53:29,311 [salt.minion      :1308][INFO    ][1753] User sudo_ubuntu Executing command pillar.get with jid 20190915035329307741
2019-09-15 03:53:29,320 [salt.minion      :1432][INFO    ][5869] Starting a new job with PID 5869
2019-09-15 03:53:29,325 [salt.minion      :1711][INFO    ][5869] Returning information for job: 20190915035329307741
2019-09-15 03:53:51,842 [salt.minion      :1308][INFO    ][1753] User sudo_ubuntu Executing command test.ping with jid 20190915035351836868
2019-09-15 03:53:51,859 [salt.minion      :1432][INFO    ][5979] Starting a new job with PID 5979
2019-09-15 03:53:51,877 [salt.minion      :1711][INFO    ][5979] Returning information for job: 20190915035351836868
2019-09-15 03:57:05,464 [salt.minion      :1308][INFO    ][1753] User sudo_ubuntu Executing command state.sls with jid 20190915035705449435
2019-09-15 03:57:05,475 [salt.minion      :1432][INFO    ][6148] Starting a new job with PID 6148
2019-09-15 03:57:06,147 [salt.state       :915 ][INFO    ][6148] Loading fresh modules for state activity
2019-09-15 03:57:06,186 [salt.fileclient  :1219][INFO    ][6148] Fetching file from saltenv 'base', ** done ** 'keepalived/init.sls'
2019-09-15 03:57:06,219 [salt.fileclient  :1219][INFO    ][6148] Fetching file from saltenv 'base', ** done ** 'keepalived/cluster.sls'
2019-09-15 03:57:06,779 [salt.state       :1780][INFO    ][6148] Running state [keepalived] at time 03:57:06.779858
2019-09-15 03:57:06,780 [salt.state       :1813][INFO    ][6148] Executing state pkg.installed for [keepalived]
2019-09-15 03:57:06,781 [salt.loaded.int.module.cmdmod:395 ][INFO    ][6148] Executing command ['dpkg-query', '--showformat', '${Status} ${Package} ${Version} ${Architecture}', '-W'] in directory '/root'
2019-09-15 03:57:07,092 [salt.loaded.int.module.cmdmod:395 ][INFO    ][6148] Executing command ['apt-cache', '-q', 'policy', 'keepalived'] in directory '/root'
2019-09-15 03:57:07,165 [salt.loaded.int.module.cmdmod:395 ][INFO    ][6148] Executing command ['apt-get', '-q', 'update'] in directory '/root'
2019-09-15 03:57:08,992 [salt.loaded.int.module.cmdmod:395 ][INFO    ][6148] Executing command ['dpkg', '--get-selections', '*'] in directory '/root'
2019-09-15 03:57:09,013 [salt.loaded.int.module.cmdmod:395 ][INFO    ][6148] Executing command ['systemd-run', '--scope', 'apt-get', '-q', '-y', '-o', 'DPkg::Options::=--force-confold', '-o', 'DPkg::Options::=--force-confdef', 'install', 'keepalived'] in directory '/root'
2019-09-15 03:57:16,874 [salt.loaded.int.module.cmdmod:395 ][INFO    ][6148] Executing command ['dpkg-query', '--showformat', '${Status} ${Package} ${Version} ${Architecture}', '-W'] in directory '/root'
2019-09-15 03:57:16,906 [salt.state       :300 ][INFO    ][6148] Made the following changes:
'libsnmp30' changed from 'absent' to '5.7.3+dfsg-1ubuntu4.4'
'libsensors4' changed from 'absent' to '1:3.4.0-2'
'libsnmp-base' changed from 'absent' to '5.7.3+dfsg-1ubuntu4.4'
'keepalived' changed from 'absent' to '1:1.2.24-1ubuntu0.16.04.2'
'ipvsadm' changed from 'absent' to '1:1.28-3ubuntu0.16.04.1'
'libnl-route-3-200' changed from 'absent' to '3.2.27-1ubuntu0.16.04.1'

2019-09-15 03:57:16,921 [salt.state       :915 ][INFO    ][6148] Loading fresh modules for state activity
2019-09-15 03:57:16,944 [salt.state       :1951][INFO    ][6148] Completed state [keepalived] at time 03:57:16.944484 duration_in_ms=10164.625
2019-09-15 03:57:16,951 [salt.state       :1780][INFO    ][6148] Running state [lsof] at time 03:57:16.951330
2019-09-15 03:57:16,951 [salt.state       :1813][INFO    ][6148] Executing state pkg.installed for [lsof]
2019-09-15 03:57:17,417 [salt.state       :300 ][INFO    ][6148] All specified packages are already installed
2019-09-15 03:57:17,417 [salt.state       :1951][INFO    ][6148] Completed state [lsof] at time 03:57:17.417318 duration_in_ms=465.988
2019-09-15 03:57:17,419 [salt.state       :1780][INFO    ][6148] Running state [/etc/keepalived/keepalived.conf] at time 03:57:17.419559
2019-09-15 03:57:17,419 [salt.state       :1813][INFO    ][6148] Executing state file.managed for [/etc/keepalived/keepalived.conf]
2019-09-15 03:57:17,441 [salt.fileclient  :1219][INFO    ][6148] Fetching file from saltenv 'base', ** done ** 'keepalived/files/keepalived.conf'
2019-09-15 03:57:17,473 [salt.state       :300 ][INFO    ][6148] File changed:
New file
2019-09-15 03:57:17,473 [salt.state       :1951][INFO    ][6148] Completed state [/etc/keepalived/keepalived.conf] at time 03:57:17.473486 duration_in_ms=53.927
2019-09-15 03:57:17,473 [salt.state       :1780][INFO    ][6148] Running state [/usr/local/bin/vrrp_script_check_pidof.sh] at time 03:57:17.473653
2019-09-15 03:57:17,473 [salt.state       :1813][INFO    ][6148] Executing state file.managed for [/usr/local/bin/vrrp_script_check_pidof.sh]
2019-09-15 03:57:18,549 [salt.fileclient  :1219][INFO    ][6148] Fetching file from saltenv 'base', ** done ** 'keepalived/files/vrrp_script_check_pidof.sh'
2019-09-15 03:57:18,554 [salt.state       :300 ][INFO    ][6148] File changed:
New file
2019-09-15 03:57:18,554 [salt.state       :1951][INFO    ][6148] Completed state [/usr/local/bin/vrrp_script_check_pidof.sh] at time 03:57:18.554816 duration_in_ms=1081.163
2019-09-15 03:57:18,555 [salt.state       :1780][INFO    ][6148] Running state [keepalived] at time 03:57:18.555834
2019-09-15 03:57:18,556 [salt.state       :1813][INFO    ][6148] Executing state service.running for [keepalived]
2019-09-15 03:57:18,556 [salt.loaded.int.module.cmdmod:395 ][INFO    ][6148] Executing command ['systemctl', 'status', 'keepalived.service', '-n', '0'] in directory '/root'
2019-09-15 03:57:18,572 [salt.loaded.int.module.cmdmod:395 ][INFO    ][6148] Executing command ['systemctl', 'is-active', 'keepalived.service'] in directory '/root'
2019-09-15 03:57:18,586 [salt.loaded.int.module.cmdmod:395 ][INFO    ][6148] Executing command ['systemctl', 'is-enabled', 'keepalived.service'] in directory '/root'
2019-09-15 03:57:18,600 [salt.loaded.int.module.cmdmod:395 ][INFO    ][6148] Executing command ['systemd-run', '--scope', 'systemctl', 'start', 'keepalived.service'] in directory '/root'
2019-09-15 03:57:18,710 [salt.loaded.int.module.cmdmod:395 ][INFO    ][6148] Executing command ['systemctl', 'is-active', 'keepalived.service'] in directory '/root'
2019-09-15 03:57:18,724 [salt.loaded.int.module.cmdmod:395 ][INFO    ][6148] Executing command ['systemctl', 'is-enabled', 'keepalived.service'] in directory '/root'
2019-09-15 03:57:18,736 [salt.loaded.int.module.cmdmod:395 ][INFO    ][6148] Executing command ['systemctl', 'is-enabled', 'keepalived.service'] in directory '/root'
2019-09-15 03:57:18,747 [salt.state       :300 ][INFO    ][6148] {'keepalived': True}
2019-09-15 03:57:18,747 [salt.state       :1951][INFO    ][6148] Completed state [keepalived] at time 03:57:18.747809 duration_in_ms=191.975
2019-09-15 03:57:18,749 [salt.minion      :1711][INFO    ][6148] Returning information for job: 20190915035705449435
2019-09-15 03:58:47,609 [salt.minion      :1308][INFO    ][1753] User sudo_ubuntu Executing command pillar.get with jid 20190915035847599479
2019-09-15 03:58:47,627 [salt.minion      :1432][INFO    ][7519] Starting a new job with PID 7519
2019-09-15 03:58:47,635 [salt.minion      :1711][INFO    ][7519] Returning information for job: 20190915035847599479
2019-09-15 04:10:56,284 [salt.minion      :1308][INFO    ][1753] User sudo_ubuntu Executing command state.sls with jid 20190915041056271079
2019-09-15 04:10:56,296 [salt.minion      :1432][INFO    ][7691] Starting a new job with PID 7691
2019-09-15 04:10:57,167 [salt.state       :915 ][INFO    ][7691] Loading fresh modules for state activity
2019-09-15 04:10:57,587 [salt.fileclient  :1219][INFO    ][7691] Fetching file from saltenv 'base', ** done ** 'haproxy/init.sls'
2019-09-15 04:10:57,606 [salt.fileclient  :1219][INFO    ][7691] Fetching file from saltenv 'base', ** done ** 'haproxy/proxy.sls'
2019-09-15 04:10:58,163 [salt.state       :1780][INFO    ][7691] Running state [haproxy] at time 04:10:58.163618
2019-09-15 04:10:58,164 [salt.state       :1813][INFO    ][7691] Executing state pkg.installed for [haproxy]
2019-09-15 04:10:58,164 [salt.loaded.int.module.cmdmod:395 ][INFO    ][7691] Executing command ['dpkg-query', '--showformat', '${Status} ${Package} ${Version} ${Architecture}', '-W'] in directory '/root'
2019-09-15 04:10:58,494 [salt.loaded.int.module.cmdmod:395 ][INFO    ][7691] Executing command ['apt-cache', '-q', 'policy', 'haproxy'] in directory '/root'
2019-09-15 04:10:58,553 [salt.loaded.int.module.cmdmod:395 ][INFO    ][7691] Executing command ['apt-get', '-q', 'update'] in directory '/root'
2019-09-15 04:11:00,410 [salt.loaded.int.module.cmdmod:395 ][INFO    ][7691] Executing command ['dpkg', '--get-selections', '*'] in directory '/root'
2019-09-15 04:11:00,431 [salt.loaded.int.module.cmdmod:395 ][INFO    ][7691] Executing command ['systemd-run', '--scope', 'apt-get', '-q', '-y', '-o', 'DPkg::Options::=--force-confold', '-o', 'DPkg::Options::=--force-confdef', 'install', 'haproxy'] in directory '/root'
2019-09-15 04:11:08,785 [salt.loaded.int.module.cmdmod:395 ][INFO    ][7691] Executing command ['dpkg-query', '--showformat', '${Status} ${Package} ${Version} ${Architecture}', '-W'] in directory '/root'
2019-09-15 04:11:08,819 [salt.state       :300 ][INFO    ][7691] Made the following changes:
'haproxy' changed from 'absent' to '1.6.3-1ubuntu0.2'
'liblua5.3-0' changed from 'absent' to '5.3.1-1ubuntu2.1'

2019-09-15 04:11:08,839 [salt.state       :915 ][INFO    ][7691] Loading fresh modules for state activity
2019-09-15 04:11:08,869 [salt.state       :1951][INFO    ][7691] Completed state [haproxy] at time 04:11:08.868938 duration_in_ms=10705.32
2019-09-15 04:11:08,873 [salt.state       :1780][INFO    ][7691] Running state [/etc/default/haproxy] at time 04:11:08.873243
2019-09-15 04:11:08,873 [salt.state       :1813][INFO    ][7691] Executing state file.managed for [/etc/default/haproxy]
2019-09-15 04:11:08,896 [salt.fileclient  :1219][INFO    ][7691] Fetching file from saltenv 'base', ** done ** 'haproxy/files/haproxy.default'
2019-09-15 04:11:08,899 [salt.state       :300 ][INFO    ][7691] File changed:
--- 
+++ 
@@ -1,10 +1,5 @@
-# Defaults file for HAProxy
-#
-# This is sourced by both, the initscript and the systemd unit file, so do not
-# treat it as a shell script fragment.
 
-# Change the config file location if needed
-#CONFIG="/etc/haproxy/haproxy.cfg"
-
-# Add extra flags here, see haproxy(1) for a few options
+# Set ENABLED to 1 if you want the init script to start haproxy.
+ENABLED=1
+# Add extra flags here.
 #EXTRAOPTS="-de -m 16"

2019-09-15 04:11:08,902 [salt.state       :1951][INFO    ][7691] Completed state [/etc/default/haproxy] at time 04:11:08.902749 duration_in_ms=29.506
2019-09-15 04:11:08,903 [salt.state       :1780][INFO    ][7691] Running state [/etc/haproxy/haproxy.cfg] at time 04:11:08.903137
2019-09-15 04:11:08,903 [salt.state       :1813][INFO    ][7691] Executing state file.managed for [/etc/haproxy/haproxy.cfg]
2019-09-15 04:11:08,919 [salt.fileclient  :1219][INFO    ][7691] Fetching file from saltenv 'base', ** done ** 'haproxy/files/haproxy.cfg'
2019-09-15 04:11:09,046 [salt.state       :300 ][INFO    ][7691] File changed:
--- 
+++ 
@@ -1,35 +1,47 @@
 global
-	log /dev/log	local0
-	log /dev/log	local1 notice
-	chroot /var/lib/haproxy
-	stats socket /run/haproxy/admin.sock mode 660 level admin
-	stats timeout 30s
-	user haproxy
-	group haproxy
-	daemon
-
-	# Default SSL material locations
-	ca-base /etc/ssl/certs
-	crt-base /etc/ssl/private
-
-	# Default ciphers to use on SSL-enabled listening sockets.
-	# For more information, see ciphers(1SSL). This list is from:
-	#  https://hynek.me/articles/hardening-your-web-servers-ssl-ciphers/
-	ssl-default-bind-ciphers ECDH+AESGCM:DH+AESGCM:ECDH+AES256:DH+AES256:ECDH+AES128:DH+AES:ECDH+3DES:DH+3DES:RSA+AESGCM:RSA+AES:RSA+3DES:!aNULL:!MD5:!DSS
-	ssl-default-bind-options no-sslv3
+  log /dev/log  local0
+  log /dev/log  local1 notice
+  chroot /var/lib/haproxy
+  stats  socket /run/haproxy/admin.sock mode 660 level admin
+  stats timeout 30s
+  user  haproxy
+  group haproxy
+  daemon
+  pidfile  /var/run/haproxy.pid
+  spread-checks 4
+  tune.maxrewrite 1024
+  tune.bufsize 32768
+  maxconn  25000
+  # SSL options
+  ca-base /etc/haproxy/ssl
+  crt-base /etc/haproxy/ssl
+  tune.ssl.default-dh-param 2048
+  ssl-default-bind-ciphers ECDHE-ECDSA-CHACHA20-POLY1305:ECDHE-RSA-CHACHA20-POLY1305:ECDHE-ECDSA-AES128-GCM-SHA256:ECDHE-RSA-AES128-GCM-SHA256:ECDHE-ECDSA-AES256-GCM-SHA384:ECDHE-RSA-AES256-GCM-SHA384:DHE-RSA-AES128-GCM-SHA256:DHE-RSA-AES256-GCM-SHA384:ECDHE-ECDSA-AES128-SHA256:ECDHE-RSA-AES128-SHA256:ECDHE-ECDSA-AES128-SHA:ECDHE-RSA-AES256-SHA384:ECDHE-RSA-AES128-SHA:ECDHE-ECDSA-AES256-SHA384:ECDHE-ECDSA-AES256-SHA:ECDHE-RSA-AES256-SHA:DHE-RSA-AES128-SHA256:DHE-RSA-AES128-SHA:DHE-RSA-AES256-SHA256:DHE-RSA-AES256-SHA:ECDHE-ECDSA-DES-CBC3-SHA:ECDHE-RSA-DES-CBC3-SHA:EDH-RSA-DES-CBC3-SHA:AES128-GCM-SHA256:AES256-GCM-SHA384:AES128-SHA256:AES256-SHA256:AES128-SHA:AES256-SHA:DES-CBC3-SHA:!DSS
+  ssl-default-bind-options no-sslv3 no-tls-tickets
+  ssl-default-server-ciphers ECDHE-ECDSA-CHACHA20-POLY1305:ECDHE-RSA-CHACHA20-POLY1305:ECDHE-ECDSA-AES128-GCM-SHA256:ECDHE-RSA-AES128-GCM-SHA256:ECDHE-ECDSA-AES256-GCM-SHA384:ECDHE-RSA-AES256-GCM-SHA384:DHE-RSA-AES128-GCM-SHA256:DHE-RSA-AES256-GCM-SHA384:ECDHE-ECDSA-AES128-SHA256:ECDHE-RSA-AES128-SHA256:ECDHE-ECDSA-AES128-SHA:ECDHE-RSA-AES256-SHA384:ECDHE-RSA-AES128-SHA:ECDHE-ECDSA-AES256-SHA384:ECDHE-ECDSA-AES256-SHA:ECDHE-RSA-AES256-SHA:DHE-RSA-AES128-SHA256:DHE-RSA-AES128-SHA:DHE-RSA-AES256-SHA256:DHE-RSA-AES256-SHA:ECDHE-ECDSA-DES-CBC3-SHA:ECDHE-RSA-DES-CBC3-SHA:EDH-RSA-DES-CBC3-SHA:AES128-GCM-SHA256:AES256-GCM-SHA384:AES128-SHA256:AES256-SHA256:AES128-SHA:AES256-SHA:DES-CBC3-SHA:!DSS
+  ssl-default-server-options no-sslv3 no-tls-tickets
 
 defaults
-	log	global
-	mode	http
-	option	httplog
-	option	dontlognull
-        timeout connect 5000
-        timeout client  50000
-        timeout server  50000
-	errorfile 400 /etc/haproxy/errors/400.http
-	errorfile 403 /etc/haproxy/errors/403.http
-	errorfile 408 /etc/haproxy/errors/408.http
-	errorfile 500 /etc/haproxy/errors/500.http
-	errorfile 502 /etc/haproxy/errors/502.http
-	errorfile 503 /etc/haproxy/errors/503.http
-	errorfile 504 /etc/haproxy/errors/504.http
+  log  global
+  mode http
+
+  maxconn 8000
+  option  redispatch
+  retries  3
+  stats  enable
+
+  timeout http-request 10s
+  timeout queue 1m
+  timeout connect 10s
+  timeout client 1m
+  timeout server 1m
+  timeout check 10s
+
+listen opendaylight_api
+  bind 10.167.4.39:8282 
+  mode http
+  balance source
+  option  httplog
+  server odl01 10.167.4.40:8282 check inter 20s fastinter 2s
+  server odl02 10.167.4.41:8282 check inter 20s fastinter 2s
+  server odl03 10.167.4.42:8282 check inter 20s fastinter 2s

2019-09-15 04:11:09,046 [salt.state       :1951][INFO    ][7691] Completed state [/etc/haproxy/haproxy.cfg] at time 04:11:09.046232 duration_in_ms=143.095
2019-09-15 04:11:09,046 [salt.state       :1780][INFO    ][7691] Running state [/etc/haproxy/ssl] at time 04:11:09.046492
2019-09-15 04:11:09,046 [salt.state       :1813][INFO    ][7691] Executing state file.directory for [/etc/haproxy/ssl]
2019-09-15 04:11:09,047 [salt.state       :300 ][INFO    ][7691] {'/etc/haproxy/ssl': 'New Dir'}
2019-09-15 04:11:09,048 [salt.state       :1951][INFO    ][7691] Completed state [/etc/haproxy/ssl] at time 04:11:09.048026 duration_in_ms=1.535
2019-09-15 04:11:09,048 [salt.state       :1780][INFO    ][7691] Running state [/etc/haproxy/errors/429.http11] at time 04:11:09.048249
2019-09-15 04:11:09,048 [salt.state       :1813][INFO    ][7691] Executing state file.managed for [/etc/haproxy/errors/429.http11]
2019-09-15 04:11:09,062 [salt.fileclient  :1219][INFO    ][7691] Fetching file from saltenv 'base', ** done ** 'haproxy/files/errors/429.http11'
2019-09-15 04:11:09,069 [salt.state       :300 ][INFO    ][7691] File changed:
New file
2019-09-15 04:11:09,070 [salt.state       :1951][INFO    ][7691] Completed state [/etc/haproxy/errors/429.http11] at time 04:11:09.069988 duration_in_ms=21.739
2019-09-15 04:11:09,070 [salt.state       :1780][INFO    ][7691] Running state [haproxy_status_packages] at time 04:11:09.070801
2019-09-15 04:11:09,071 [salt.state       :1813][INFO    ][7691] Executing state pkg.installed for [haproxy_status_packages]
2019-09-15 04:11:09,608 [salt.loaded.int.module.cmdmod:395 ][INFO    ][7691] Executing command ['dpkg', '--get-selections', '*'] in directory '/root'
2019-09-15 04:11:09,626 [salt.loaded.int.module.cmdmod:395 ][INFO    ][7691] Executing command ['systemd-run', '--scope', 'apt-get', '-q', '-y', '-o', 'DPkg::Options::=--force-confold', '-o', 'DPkg::Options::=--force-confdef', 'install', 'socat'] in directory '/root'
2019-09-15 04:11:11,332 [salt.minion      :1308][INFO    ][1753] User sudo_ubuntu Executing command saltutil.find_job with jid 20190915041111320477
2019-09-15 04:11:11,344 [salt.minion      :1432][INFO    ][8699] Starting a new job with PID 8699
2019-09-15 04:11:11,362 [salt.minion      :1711][INFO    ][8699] Returning information for job: 20190915041111320477
2019-09-15 04:11:12,431 [salt.loaded.int.module.cmdmod:395 ][INFO    ][7691] Executing command ['dpkg-query', '--showformat', '${Status} ${Package} ${Version} ${Architecture}', '-W'] in directory '/root'
2019-09-15 04:11:12,459 [salt.state       :300 ][INFO    ][7691] Made the following changes:
'socat' changed from 'absent' to '1.7.3.1-1'

2019-09-15 04:11:12,471 [salt.state       :915 ][INFO    ][7691] Loading fresh modules for state activity
2019-09-15 04:11:12,497 [salt.state       :1951][INFO    ][7691] Completed state [haproxy_status_packages] at time 04:11:12.497607 duration_in_ms=3426.806
2019-09-15 04:11:12,501 [salt.state       :1780][INFO    ][7691] Running state [/usr/bin/haproxy-status.sh] at time 04:11:12.501053
2019-09-15 04:11:12,501 [salt.state       :1813][INFO    ][7691] Executing state file.managed for [/usr/bin/haproxy-status.sh]
2019-09-15 04:11:12,520 [salt.fileclient  :1219][INFO    ][7691] Fetching file from saltenv 'base', ** done ** 'haproxy/files/haproxy-status.sh'
2019-09-15 04:11:12,541 [salt.state       :300 ][INFO    ][7691] File changed:
New file
2019-09-15 04:11:12,542 [salt.state       :1951][INFO    ][7691] Completed state [/usr/bin/haproxy-status.sh] at time 04:11:12.542008 duration_in_ms=40.955
2019-09-15 04:11:12,568 [salt.state       :1780][INFO    ][7691] Running state [net.ipv4.ip_nonlocal_bind] at time 04:11:12.568363
2019-09-15 04:11:12,568 [salt.state       :1813][INFO    ][7691] Executing state sysctl.present for [net.ipv4.ip_nonlocal_bind]
2019-09-15 04:11:12,570 [salt.loaded.int.module.cmdmod:395 ][INFO    ][7691] Executing command 'sysctl -w net.ipv4.ip_nonlocal_bind="1"' in directory '/root'
2019-09-15 04:11:12,588 [salt.state       :300 ][INFO    ][7691] {'net.ipv4.ip_nonlocal_bind': 1}
2019-09-15 04:11:12,589 [salt.state       :1951][INFO    ][7691] Completed state [net.ipv4.ip_nonlocal_bind] at time 04:11:12.589136 duration_in_ms=20.773
2019-09-15 04:11:12,941 [salt.state       :1780][INFO    ][7691] Running state [haproxy] at time 04:11:12.941567
2019-09-15 04:11:12,942 [salt.state       :1813][INFO    ][7691] Executing state service.running for [haproxy]
2019-09-15 04:11:12,942 [salt.loaded.int.module.cmdmod:395 ][INFO    ][7691] Executing command ['systemctl', 'status', 'haproxy.service', '-n', '0'] in directory '/root'
2019-09-15 04:11:12,955 [salt.loaded.int.module.cmdmod:395 ][INFO    ][7691] Executing command ['systemctl', 'is-active', 'haproxy.service'] in directory '/root'
2019-09-15 04:11:12,966 [salt.loaded.int.module.cmdmod:395 ][INFO    ][7691] Executing command ['systemctl', 'is-enabled', 'haproxy.service'] in directory '/root'
2019-09-15 04:11:12,977 [salt.state       :300 ][INFO    ][7691] The service haproxy is already running
2019-09-15 04:11:12,977 [salt.state       :1951][INFO    ][7691] Completed state [haproxy] at time 04:11:12.977733 duration_in_ms=36.167
2019-09-15 04:11:12,978 [salt.state       :1780][INFO    ][7691] Running state [haproxy] at time 04:11:12.978120
2019-09-15 04:11:12,978 [salt.state       :1813][INFO    ][7691] Executing state service.mod_watch for [haproxy]
2019-09-15 04:11:12,979 [salt.loaded.int.module.cmdmod:395 ][INFO    ][7691] Executing command ['systemctl', 'is-active', 'haproxy.service'] in directory '/root'
2019-09-15 04:11:12,991 [salt.loaded.int.module.cmdmod:395 ][INFO    ][7691] Executing command ['systemd-run', '--scope', 'systemctl', 'restart', 'haproxy.service'] in directory '/root'
2019-09-15 04:11:13,014 [salt.state       :300 ][INFO    ][7691] {'haproxy': True}
2019-09-15 04:11:13,014 [salt.state       :1951][INFO    ][7691] Completed state [haproxy] at time 04:11:13.014537 duration_in_ms=36.416
2019-09-15 04:11:13,016 [salt.minion      :1711][INFO    ][7691] Returning information for job: 20190915041056271079
2019-09-15 04:11:13,958 [salt.minion      :1308][INFO    ][1753] User sudo_ubuntu Executing command service.status with jid 20190915041113949044
2019-09-15 04:11:13,973 [salt.minion      :1432][INFO    ][8826] Starting a new job with PID 8826
2019-09-15 04:11:14,364 [salt.loader.192.168.11.2.int.module.cmdmod:395 ][INFO    ][8826] Executing command ['systemctl', 'status', 'haproxy.service', '-n', '0'] in directory '/root'
2019-09-15 04:11:14,377 [salt.loader.192.168.11.2.int.module.cmdmod:395 ][INFO    ][8826] Executing command ['systemctl', 'is-active', 'haproxy.service'] in directory '/root'
2019-09-15 04:11:14,390 [salt.minion      :1711][INFO    ][8826] Returning information for job: 20190915041113949044
2019-09-15 04:11:15,199 [salt.minion      :1308][INFO    ][1753] User sudo_ubuntu Executing command service.restart with jid 20190915041115189108
2019-09-15 04:11:15,217 [salt.minion      :1432][INFO    ][8836] Starting a new job with PID 8836
2019-09-15 04:11:15,586 [salt.loader.192.168.11.2.int.module.cmdmod:395 ][INFO    ][8836] Executing command ['systemctl', 'status', 'rsyslog.service', '-n', '0'] in directory '/root'
2019-09-15 04:11:15,610 [salt.loader.192.168.11.2.int.module.cmdmod:395 ][INFO    ][8836] Executing command ['systemd-run', '--scope', 'systemctl', 'restart', 'rsyslog.service'] in directory '/root'
2019-09-15 04:11:15,637 [salt.minion      :1711][INFO    ][8836] Returning information for job: 20190915041115189108
2019-09-15 04:48:52,681 [salt.utils.schedule:1377][INFO    ][1753] Running scheduled job: __mine_interval
2019-09-15 05:00:40,847 [salt.minion      :1308][INFO    ][1753] User sudo_ubuntu Executing command cp.push_dir with jid 20190915050040835773
2019-09-15 05:00:40,859 [salt.minion      :1432][INFO    ][9575] Starting a new job with PID 9575
