SeaBIOS (version 1.8.2-20191010_205345-google) Total RAM Size = 0x00000000f0000000 = 3840 MiB CPUs found: 1 Max CPUs supported: 1 Comparing RSDP and RSDP Comparing RSDT and RSDT Comparing FACP and FACP Comparing FACS and FACS return 0 for FACS vs FACS: SUCCESS Comparing DSDT and DSDT return 0 for DSDT vs DSDT: SUCCESS return 0 for FACP vs FACP: SUCCESS Comparing SRAT and SRAT return 0 for SRAT vs SRAT: SUCCESS Comparing APIC and APIC return 0 for APIC vs APIC: SUCCESS Comparing SSDT and SSDT return 0 for SSDT vs SSDT: SUCCESS Comparing WAET and WAET return 0 for WAET vs WAET: SUCCESS return 0 for RSDT vs RSDT: SUCCESS return 0 for RSDP vs RSDP: SUCCESS found virtio-scsi at 0:3 virtio-scsi vendor='Google' product='PersistentDisk' rev='1' type=0 removable=0 virtio-scsi blksize=512 sectors=104857600 = 51200 MiB drive 0x000f2830: PCHS=0/0/0 translation=lba LCHS=1024/255/63 s=104857600 Sending Seabios boot VM event. Booting from Hard Disk 0... [ 0.000000] Linux version 5.0.0-1025-gcp (buildd@lcy01-amd64-001) (gcc version 7.4.0 (Ubuntu 7.4.0-1ubuntu1~18.04.1)) #26~18.04.1-Ubuntu SMP Mon Nov 11 13:09:18 UTC 2019 (Ubuntu 5.0.0-1025.26~18.04.1-gcp 5.0.21) [ 0.000000] Command line: BOOT_IMAGE=/boot/vmlinuz-5.0.0-1025-gcp root=PARTUUID=a0d4cd9e-2a82-428c-af79-d684141d2d98 ro scsi_mod.use_blk_mq=Y console=ttyS0 [ 0.000000] KERNEL supported cpus: [ 0.000000] Intel GenuineIntel [ 0.000000] AMD AuthenticAMD [ 0.000000] Hygon HygonGenuine [ 0.000000] Centaur CentaurHauls [ 0.000000] x86/fpu: Supporting XSAVE feature 0x001: 'x87 floating point registers' [ 0.000000] x86/fpu: Supporting XSAVE feature 0x002: 'SSE registers' [ 0.000000] x86/fpu: Supporting XSAVE feature 0x004: 'AVX registers' [ 0.000000] x86/fpu: Supporting XSAVE feature 0x008: 'MPX bounds registers' [ 0.000000] x86/fpu: Supporting XSAVE feature 0x010: 'MPX CSR' [ 0.000000] x86/fpu: Supporting XSAVE feature 0x020: 'AVX-512 opmask' [ 0.000000] x86/fpu: Supporting XSAVE feature 0x040: 'AVX-512 Hi256' [ 0.000000] x86/fpu: Supporting XSAVE feature 0x080: 'AVX-512 ZMM_Hi256' [ 0.000000] x86/fpu: xstate_offset[2]: 576, xstate_sizes[2]: 256 [ 0.000000] x86/fpu: xstate_offset[3]: 832, xstate_sizes[3]: 64 [ 0.000000] x86/fpu: xstate_offset[4]: 896, xstate_sizes[4]: 64 [ 0.000000] x86/fpu: xstate_offset[5]: 960, xstate_sizes[5]: 64 [ 0.000000] x86/fpu: xstate_offset[6]: 1024, xstate_sizes[6]: 512 [ 0.000000] x86/fpu: xstate_offset[7]: 1536, xstate_sizes[7]: 1024 [ 0.000000] x86/fpu: Enabled xstate features 0xff, context size is 2560 bytes, using 'compacted' format. [ 0.000000] BIOS-provided physical RAM map: [ 0.000000] BIOS-e820: [mem 0x0000000000000000-0x000000000009fbff] usable [ 0.000000] BIOS-e820: [mem 0x000000000009fc00-0x000000000009ffff] reserved [ 0.000000] BIOS-e820: [mem 0x00000000000f0000-0x00000000000fffff] reserved [ 0.000000] BIOS-e820: [mem 0x0000000000100000-0x00000000bfffcfff] usable [ 0.000000] BIOS-e820: [mem 0x00000000bfffd000-0x00000000bfffffff] reserved [ 0.000000] BIOS-e820: [mem 0x00000000fffbc000-0x00000000ffffffff] reserved [ 0.000000] BIOS-e820: [mem 0x0000000100000000-0x000000012fffffff] usable [ 0.000000] NX (Execute Disable) protection: active [ 0.000000] SMBIOS 2.4 present. [ 0.000000] DMI: Google Google Compute Engine/Google Compute Engine, BIOS Google 01/01/2011 [ 0.000000] Hypervisor detected: KVM [ 0.000000] kvm-clock: Using msrs 4b564d01 and 4b564d00 [ 0.000000] kvm-clock: cpu 0, msr 59a01001, primary cpu clock [ 0.000000] kvm-clock: using sched offset of 1316960935 cycles [ 0.000002] clocksource: kvm-clock: mask: 0xffffffffffffffff max_cycles: 0x1cd42e4dffb, max_idle_ns: 881590591483 ns [ 0.000004] tsc: Detected 2000.156 MHz processor [ 0.000600] last_pfn = 0x130000 max_arch_pfn = 0x400000000 [ 0.000664] x86/PAT: Configuration [0-7]: WB WC UC- UC WB WP UC- WT [ 0.000675] last_pfn = 0xbfffd max_arch_pfn = 0x400000000 [ 0.005074] found SMP MP-table at [mem 0x000f2ac0-0x000f2acf] [ 0.005171] check: Scanning 1 areas for low memory corruption [ 0.005205] Using GB pages for direct mapping [ 0.006131] ACPI: Early table checksum verification disabled [ 0.006182] ACPI: RSDP 0x00000000000F2870 000014 (v00 Google) [ 0.006186] ACPI: RSDT 0x00000000BFFFFFA0 000038 (v01 Google GOOGRSDT 00000001 GOOG 00000001) [ 0.006193] ACPI: FACP 0x00000000BFFFF400 0000F4 (v02 Google GOOGFACP 00000001 GOOG 00000001) [ 0.006200] ACPI: DSDT 0x00000000BFFFDB40 0018BA (v01 Google GOOGDSDT 00000001 GOOG 00000001) [ 0.006203] ACPI: FACS 0x00000000BFFFDB00 000040 [ 0.006207] ACPI: FACS 0x00000000BFFFDB00 000040 [ 0.006210] ACPI: SRAT 0x00000000BFFFFEC0 0000B8 (v01 Google GOOGSRAT 00000001 GOOG 00000001) [ 0.006214] ACPI: APIC 0x00000000BFFFFE20 00006E (v01 Google GOOGAPIC 00000001 GOOG 00000001) [ 0.006217] ACPI: SSDT 0x00000000BFFFF500 00091F (v01 Google GOOGSSDT 00000001 GOOG 00000001) [ 0.006221] ACPI: WAET 0x00000000BFFFFE90 000028 (v01 Google GOOGWAET 00000001 GOOG 00000001) [ 0.006312] SRAT: PXM 0 -> APIC 0x00 -> Node 0 [ 0.006317] ACPI: SRAT: Node 0 PXM 0 [mem 0x00000000-0x0009ffff] [ 0.006319] ACPI: SRAT: Node 0 PXM 0 [mem 0x00100000-0xbfffffff] [ 0.006321] ACPI: SRAT: Node 0 PXM 0 [mem 0x100000000-0x12fffffff] [ 0.006325] NUMA: Node 0 [mem 0x00000000-0x0009ffff] + [mem 0x00100000-0xbfffffff] -> [mem 0x00000000-0xbfffffff] [ 0.006328] NUMA: Node 0 [mem 0x00000000-0xbfffffff] + [mem 0x100000000-0x12fffffff] -> [mem 0x00000000-0x12fffffff] [ 0.006340] NODE_DATA(0) allocated [mem 0x12ffd3000-0x12fffdfff] [ 0.007216] Zone ranges: [ 0.007217] DMA [mem 0x0000000000001000-0x0000000000ffffff] [ 0.007218] DMA32 [mem 0x0000000001000000-0x00000000ffffffff] [ 0.007220] Normal [mem 0x0000000100000000-0x000000012fffffff] [ 0.007220] Device empty [ 0.007222] Movable zone start for each node [ 0.007234] Early memory node ranges [ 0.007235] node 0: [mem 0x0000000000001000-0x000000000009efff] [ 0.007236] node 0: [mem 0x0000000000100000-0x00000000bfffcfff] [ 0.007237] node 0: [mem 0x0000000100000000-0x000000012fffffff] [ 0.008591] Zeroed struct page in unavailable ranges: 101 pages [ 0.008592] Initmem setup node 0 [mem 0x0000000000001000-0x000000012fffffff] [ 0.049456] ACPI: PM-Timer IO Port: 0xb008 [ 0.049481] ACPI: LAPIC_NMI (acpi_id[0xff] dfl dfl lint[0x1]) [ 0.049578] IOAPIC[0]: apic_id 0, version 17, address 0xfec00000, GSI 0-23 [ 0.049581] ACPI: INT_SRC_OVR (bus 0 bus_irq 5 global_irq 5 high level) [ 0.049583] ACPI: INT_SRC_OVR (bus 0 bus_irq 9 global_irq 9 high level) [ 0.049584] ACPI: INT_SRC_OVR (bus 0 bus_irq 10 global_irq 10 high level) [ 0.049585] ACPI: INT_SRC_OVR (bus 0 bus_irq 11 global_irq 11 high level) [ 0.049591] Using ACPI (MADT) for SMP configuration information [ 0.049594] smpboot: Allowing 1 CPUs, 0 hotplug CPUs [ 0.049623] PM: Registered nosave memory: [mem 0x00000000-0x00000fff] [ 0.049626] PM: Registered nosave memory: [mem 0x0009f000-0x0009ffff] [ 0.049628] PM: Registered nosave memory: [mem 0x000a0000-0x000effff] [ 0.049630] PM: Registered nosave memory: [mem 0x000f0000-0x000fffff] [ 0.049632] PM: Registered nosave memory: [mem 0xbfffd000-0xbfffffff] [ 0.049634] PM: Registered nosave memory: [mem 0xc0000000-0xfffbbfff] [ 0.049636] PM: Registered nosave memory: [mem 0xfffbc000-0xffffffff] [ 0.049639] [mem 0xc0000000-0xfffbbfff] available for PCI devices [ 0.049641] Booting paravirtualized kernel on KVM [ 0.049645] clocksource: refined-jiffies: mask: 0xffffffff max_cycles: 0xffffffff, max_idle_ns: 7645519600211568 ns [ 0.049659] random: get_random_bytes called from start_kernel+0x97/0x516 with crng_init=0 [ 0.049669] setup_percpu: NR_CPUS:8192 nr_cpumask_bits:1 nr_cpu_ids:1 nr_node_ids:1 [ 0.050470] percpu: Embedded 46 pages/cpu s151552 r8192 d28672 u2097152 [ 0.050499] Built 1 zonelists, mobility grouping on. Total pages: 967558 [ 0.050500] Policy zone: Normal [ 0.050502] Kernel command line: BOOT_IMAGE=/boot/vmlinuz-5.0.0-1025-gcp root=PARTUUID=a0d4cd9e-2a82-428c-af79-d684141d2d98 ro scsi_mod.use_blk_mq=Y console=ttyS0 [ 0.082612] Memory: 3770872K/3931756K available (14339K kernel code, 2348K rwdata, 4436K rodata, 2588K init, 5180K bss, 160884K reserved, 0K cma-reserved) [ 0.083441] SLUB: HWalign=64, Order=0-3, MinObjects=0, CPUs=1, Nodes=1 [ 0.083447] Kernel/User page tables isolation: enabled [ 0.083463] ftrace: allocating 42092 entries in 165 pages [ 0.101657] rcu: Hierarchical RCU implementation. [ 0.101660] rcu: RCU restricting CPUs from NR_CPUS=8192 to nr_cpu_ids=1. [ 0.101662] Tasks RCU enabled. [ 0.101663] rcu: RCU calculated value of scheduler-enlistment delay is 25 jiffies. [ 0.101663] rcu: Adjusting geometry for rcu_fanout_leaf=16, nr_cpu_ids=1 [ 0.104241] NR_IRQS: 524544, nr_irqs: 256, preallocated irqs: 16 [ 0.105132] Console: colour VGA+ 80x25 [ 0.251817] printk: console [ttyS0] enabled [ 0.252496] ACPI: Core revision 20181213 [ 0.253906] APIC: Switch to symmetric I/O mode setup [ 0.255715] x2apic enabled [ 0.258184] Switched APIC routing to physical x2apic. [ 0.262902] ..TIMER: vector=0x30 apic1=0 pin1=0 apic2=-1 pin2=-1 [ 0.264572] clocksource: tsc-early: mask: 0xffffffffffffffff max_cycles: 0x1cd4c1a02bd, max_idle_ns: 440795302132 ns [ 0.266576] Calibrating delay loop (skipped) preset value.. 4000.31 BogoMIPS (lpj=8000624) [ 0.268840] pid_max: default: 32768 minimum: 301 [ 0.270606] LSM: Security Framework initializing [ 0.271759] Yama: becoming mindful. [ 0.272415] AppArmor: AppArmor initialized [ 0.275637] Dentry cache hash table entries: 524288 (order: 10, 4194304 bytes) [ 0.278357] Inode-cache hash table entries: 262144 (order: 9, 2097152 bytes) [ 0.278590] Mount-cache hash table entries: 8192 (order: 4, 65536 bytes) [ 0.279695] Mountpoint-cache hash table entries: 8192 (order: 4, 65536 bytes) [ 0.282993] Last level iTLB entries: 4KB 64, 2MB 8, 4MB 8 [ 0.284375] Last level dTLB entries: 4KB 64, 2MB 0, 4MB 0, 1GB 4 [ 0.286564] Spectre V1 : Mitigation: usercopy/swapgs barriers and __user pointer sanitization [ 0.288916] Spectre V2 : Mitigation: Full generic retpoline [ 0.290558] Spectre V2 : Spectre v2 / SpectreRSB mitigation: Filling RSB on context switch [ 0.292839] Spectre V2 : Enabling Restricted Speculation for firmware calls [ 0.294573] Spectre V2 : mitigation: Enabling conditional Indirect Branch Prediction Barrier [ 0.296471] Speculative Store Bypass: Mitigation: Speculative Store Bypass disabled via prctl and seccomp [ 0.298600] MDS: Mitigation: Clear CPU buffers [ 0.300119] TAA: Mitigation: Clear CPU buffers [ 0.318479] Freeing SMP alternatives memory: 36K [ 0.430291] smpboot: CPU0: Intel(R) Xeon(R) CPU @ 2.00GHz (family: 0x6, model: 0x55, stepping: 0x3) [ 0.430557] Performance Events: unsupported p6 CPU model 85 no PMU driver, software events only. [ 0.430557] rcu: Hierarchical SRCU implementation. [ 0.431562] random: crng done (trusting CPU's manufacturer) [ 0.433720] NMI watchdog: Perf NMI watchdog permanently disabled [ 0.434598] smp: Bringing up secondary CPUs ... [ 0.435249] smp: Brought up 1 node, 1 CPU [ 0.435987] smpboot: Max logical packages: 1 [ 0.436626] smpboot: Total of 1 processors activated (4000.31 BogoMIPS) [ 0.437903] devtmpfs: initialized [ 0.438472] x86/mm: Memory block size: 128MB [ 0.439005] clocksource: jiffies: mask: 0xffffffff max_cycles: 0xffffffff, max_idle_ns: 7645041785100000 ns [ 0.440466] futex hash table entries: 256 (order: 2, 16384 bytes) [ 0.441464] pinctrl core: initialized pinctrl subsystem [ 0.442738] RTC time: 22:42:12, date: 2019-11-16 [ 0.443524] NET: Registered protocol family 16 [ 0.444228] audit: initializing netlink subsys (disabled) [ 0.445174] EISA bus registered [ 0.445691] cpuidle: using governor ladder [ 0.446279] cpuidle: using governor menu [ 0.446619] ACPI: bus type PCI registered [ 0.447249] acpiphp: ACPI Hot Plug PCI Controller Driver version: 0.5 [ 0.448957] PCI: Using configuration type 1 for base access [ 0.450590] audit: type=2000 audit(1573944132.357:1): state=initialized audit_enabled=0 res=1 [ 0.452995] HugeTLB registered 1.00 GiB page size, pre-allocated 0 pages [ 0.453962] HugeTLB registered 2.00 MiB page size, pre-allocated 0 pages [ 0.454845] ACPI: Added _OSI(Module Device) [ 0.455537] ACPI: Added _OSI(Processor Device) [ 0.456229] ACPI: Added _OSI(3.0 _SCP Extensions) [ 0.456930] ACPI: Added _OSI(Processor Aggregator Device) [ 0.458568] ACPI: Added _OSI(Linux-Dell-Video) [ 0.459245] ACPI: Added _OSI(Linux-Lenovo-NV-HDMI-Audio) [ 0.460097] ACPI: Added _OSI(Linux-HPI-Hybrid-Graphics) [ 0.463010] ACPI: 2 ACPI AML tables successfully acquired and loaded [ 0.465022] ACPI: Interpreter enabled [ 0.465608] ACPI: (supports S0 S3 S4 S5) [ 0.466231] ACPI: Using IOAPIC for interrupt routing [ 0.466577] PCI: Using host bridge windows from ACPI; if necessary, use "pci=nocrs" and report a bug [ 0.468254] ACPI: Enabled 16 GPEs in block 00 to 0F [ 0.472255] ACPI: PCI Root Bridge [PCI0] (domain 0000 [bus 00-ff]) [ 0.473295] acpi PNP0A03:00: _OSC: OS supports [ASPM ClockPM Segments MSI] [ 0.474323] acpi PNP0A03:00: fail to add MMCONFIG information, can't access extended PCI configuration space under this bridge. [ 0.475335] PCI host bridge to bus 0000:00 [ 0.476026] pci_bus 0000:00: root bus resource [io 0x0000-0x0cf7 window] [ 0.477056] pci_bus 0000:00: root bus resource [io 0x0d00-0xffff window] [ 0.478560] pci_bus 0000:00: root bus resource [mem 0x000a0000-0x000bffff window] [ 0.479803] pci_bus 0000:00: root bus resource [mem 0xc0000000-0xfebfffff window] [ 0.480934] pci_bus 0000:00: root bus resource [bus 00-ff] [ 0.517807] pci 0000:00:01.3: quirk: [io 0xb000-0xb03f] claimed by PIIX4 ACPI [ 0.578737] ACPI: PCI Interrupt Link [LNKA] (IRQs 5 *10 11) [ 0.581450] ACPI: PCI Interrupt Link [LNKB] (IRQs 5 *10 11) [ 0.582654] ACPI: PCI Interrupt Link [LNKC] (IRQs 5 10 *11) [ 0.584755] ACPI: PCI Interrupt Link [LNKD] (IRQs 5 10 *11) [ 0.587605] ACPI: PCI Interrupt Link [LNKS] (IRQs *9) [ 0.588928] SCSI subsystem initialized [ 0.589596] vgaarb: loaded [ 0.590005] ACPI: bus type USB registered [ 0.590574] usbcore: registered new interface driver usbfs [ 0.591364] usbcore: registered new interface driver hub [ 0.592114] usbcore: registered new device driver usb [ 0.592983] pps_core: LinuxPPS API ver. 1 registered [ 0.593705] pps_core: Software ver. 5.3.6 - Copyright 2005-2007 Rodolfo Giometti [ 0.594564] PTP clock support registered [ 0.595418] EDAC MC: Ver: 3.0.0 [ 0.596102] PCI: Using ACPI for IRQ routing [ 0.596922] NetLabel: Initializing [ 0.597563] NetLabel: domain hash size = 128 [ 0.598560] NetLabel: protocols = UNLABELED CIPSOv4 CALIPSO [ 0.599357] NetLabel: unlabeled traffic allowed by default [ 0.600378] clocksource: Switched to clocksource kvm-clock [ 0.615756] VFS: Disk quotas dquot_6.6.0 [ 0.616426] VFS: Dquot-cache hash table entries: 512 (order 0, 4096 bytes) [ 0.618656] AppArmor: AppArmor Filesystem Enabled [ 0.619399] pnp: PnP ACPI init [ 0.620797] pnp: PnP ACPI: found 7 devices [ 0.626966] clocksource: acpi_pm: mask: 0xffffff max_cycles: 0xffffff, max_idle_ns: 2085701024 ns [ 0.628477] NET: Registered protocol family 2 [ 0.629336] tcp_listen_portaddr_hash hash table entries: 2048 (order: 3, 32768 bytes) [ 0.630459] TCP established hash table entries: 32768 (order: 6, 262144 bytes) [ 0.631601] TCP bind hash table entries: 32768 (order: 7, 524288 bytes) [ 0.632680] TCP: Hash tables configured (established 32768 bind 32768) [ 0.633826] UDP hash table entries: 2048 (order: 4, 65536 bytes) [ 0.634708] UDP-Lite hash table entries: 2048 (order: 4, 65536 bytes) [ 0.635761] NET: Registered protocol family 1 [ 0.636543] NET: Registered protocol family 44 [ 0.637294] pci 0000:00:00.0: Limiting direct PCI/PCI transfers [ 0.638335] PCI-DMA: Using software bounce buffering for IO (SWIOTLB) [ 0.639236] software IO TLB: mapped [mem 0xbbffd000-0xbfffd000] (64MB) [ 0.640279] clocksource: tsc: mask: 0xffffffffffffffff max_cycles: 0x1cd4c1a02bd, max_idle_ns: 440795302132 ns [ 0.641814] check: Scanning for low memory corruption every 60 seconds [ 0.643501] Initialise system trusted keyrings [ 0.644222] Key type blacklist registered [ 0.644879] workingset: timestamp_bits=36 max_order=20 bucket_order=0 [ 0.648287] zbud: loaded [ 0.649212] squashfs: version 4.0 (2009/01/31) Phillip Lougher [ 0.650315] fuse init (API version 7.28) [ 0.652404] Key type asymmetric registered [ 0.653069] Asymmetric key parser 'x509' registered [ 0.653952] Block layer SCSI generic (bsg) driver version 0.4 loaded (major 243) [ 0.655381] shpchp: Standard Hot Plug PCI Controller Driver version: 0.4 [ 0.656496] input: Power Button as /devices/LNXSYSTM:00/LNXPWRBN:00/input/input0 [ 0.657654] ACPI: Power Button [PWRF] [ 0.658397] input: Sleep Button as /devices/LNXSYSTM:00/LNXSLPBN:00/input/input1 [ 0.659640] ACPI: Sleep Button [SLPF] [ 0.662512] PCI Interrupt Link [LNKC] enabled at IRQ 11 [ 0.663710] virtio-pci 0000:00:03.0: virtio_pci: leaving for legacy driver [ 0.669019] PCI Interrupt Link [LNKD] enabled at IRQ 10 [ 0.669905] virtio-pci 0000:00:04.0: virtio_pci: leaving for legacy driver [ 0.674672] Serial: 8250/16550 driver, 32 ports, IRQ sharing enabled [ 0.697585] 00:03: ttyS0 at I/O 0x3f8 (irq = 4, base_baud = 115200) is a 16550A [ 0.721531] 00:04: ttyS1 at I/O 0x2f8 (irq = 3, base_baud = 115200) is a 16550A [ 0.745450] 00:05: ttyS2 at I/O 0x3e8 (irq = 6, base_baud = 115200) is a 16550A [ 0.769567] 00:06: ttyS3 at I/O 0x2e8 (irq = 7, base_baud = 115200) is a 16550A [ 0.772772] Linux agpgart interface v0.103 [ 0.776430] loop: module loaded [ 0.789351] scsi host0: Virtio SCSI HBA [ 0.810260] scsi 0:0:1:0: Direct-Access Google PersistentDisk 1 PQ: 0 ANSI: 6 [ 0.813067] libphy: Fixed MDIO Bus: probed [ 0.814305] tun: Universal TUN/TAP device driver, 1.6 [ 0.815826] PPP generic driver version 2.4.2 [ 0.817426] ehci_hcd: USB 2.0 'Enhanced' Host Controller (EHCI) Driver [ 0.819379] ehci-pci: EHCI PCI platform driver [ 0.820932] ehci-platform: EHCI generic platform driver [ 0.822523] ohci_hcd: USB 1.1 'Open' Host Controller (OHCI) Driver [ 0.824464] ohci-pci: OHCI PCI platform driver [ 0.825893] ohci-platform: OHCI generic platform driver [ 0.827871] uhci_hcd: USB Universal Host Controller Interface driver [ 0.829967] i8042: PNP: PS/2 Controller [PNP0303:KBD,PNP0f13:MOU] at 0x60,0x64 irq 1,12 [ 0.832973] i8042: Warning: Keylock active [ 0.836112] serio: i8042 KBD port at 0x60,0x64 irq 1 [ 0.837576] serio: i8042 AUX port at 0x60,0x64 irq 12 [ 0.839560] mousedev: PS/2 mouse device common for all mice [ 0.842029] rtc_cmos 00:00: RTC can wake from S4 [ 0.845528] rtc_cmos 00:00: registered as rtc0 [ 0.847066] rtc_cmos 00:00: alarms up to one day, 114 bytes nvram [ 0.848918] i2c /dev entries driver [ 0.850520] device-mapper: uevent: version 1.0.3 [ 0.852285] device-mapper: ioctl: 4.39.0-ioctl (2018-04-03) initialised: dm-devel@redhat.com [ 0.855079] platform eisa.0: Probing EISA bus 0 [ 0.856619] platform eisa.0: EISA: Cannot allocate resource for mainboard [ 0.858716] platform eisa.0: Cannot allocate resource for EISA slot 1 [ 0.860466] platform eisa.0: Cannot allocate resource for EISA slot 2 [ 0.862529] platform eisa.0: Cannot allocate resource for EISA slot 3 [ 0.864374] platform eisa.0: Cannot allocate resource for EISA slot 4 [ 0.866172] platform eisa.0: Cannot allocate resource for EISA slot 5 [ 0.868316] platform eisa.0: Cannot allocate resource for EISA slot 6 [ 0.870145] platform eisa.0: Cannot allocate resource for EISA slot 7 [ 0.872081] platform eisa.0: Cannot allocate resource for EISA slot 8 [ 0.874168] platform eisa.0: EISA: Detected 0 cards [ 0.875610] ledtrig-cpu: registered to indicate activity on CPUs [ 0.878381] NET: Registered protocol family 10 [ 0.881504] Segment Routing with IPv6 [ 0.882757] NET: Registered protocol family 17 [ 0.884112] Key type dns_resolver registered [ 0.885666] mce: Using 32 MCE banks [ 0.886974] RAS: Correctable Errors collector initialized. [ 0.888543] sched_clock: Marking stable (736570728, 150153778)->(892020567, -5296061) [ 0.891905] registered taskstats version 1 [ 0.893206] Loading compiled-in X.509 certificates [ 0.895879] Loaded X.509 cert 'Build time autogenerated kernel key: 6aa80556125908d90fc013ceadf27a024df99565' [ 0.899048] zswap: loaded using pool lzo/zbud [ 0.900496] sd 0:0:1:0: Attached scsi generic sg0 type 0 [ 0.902258] sd 0:0:1:0: [sda] 104857600 512-byte logical blocks: (53.7 GB/50.0 GiB) [ 0.904489] sd 0:0:1:0: [sda] 4096-byte physical blocks [ 0.906297] sd 0:0:1:0: [sda] Write Protect is off [ 0.907633] sd 0:0:1:0: [sda] Write cache: enabled, read cache: enabled, doesn't support DPO or FUA [ 0.910619] Key type big_key registered [ 0.911695] Key type trusted registered [ 0.912981] Key type encrypted registered [ 0.914901] AppArmor: AppArmor sha1 policy hashing enabled [ 0.916453] ima: No TPM chip found, activating TPM-bypass! [ 0.917960] ima: Allocated hash algorithm: sha1 [ 0.919390] No architecture policies found [ 0.920576] evm: Initialising EVM extended attributes: [ 0.922049] evm: security.selinux [ 0.922985] evm: security.SMACK64 [ 0.923944] evm: security.SMACK64EXEC [ 0.924999] evm: security.SMACK64TRANSMUTE [ 0.926132] evm: security.SMACK64MMAP [ 0.927191] evm: security.apparmor [ 0.928072] evm: security.ima [ 0.928909] evm: security.capability [ 0.930004] evm: HMAC attrs: 0x1 [ 0.931351] Magic number: 11:253:755 [ 0.932534] tty ttyS6: hash matches [ 0.933713] rtc_cmos 00:00: setting system clock to 2019-11-16T22:42:13 UTC (1573944133) [ 0.945150] sda: sda1 sda14 sda15 [ 0.946549] sd 0:0:1:0: [sda] Attached SCSI disk [ 1.042942] input: AT Translated Set 2 keyboard as /devices/platform/i8042/serio0/input/input2 [ 1.044770] md: Waiting for all devices to be available before autodetect [ 1.046169] md: If you don't use raid, use raid=noautodetect [ 1.047792] md: Autodetecting RAID arrays. [ 1.048569] md: autorun ... [ 1.049190] md: ... autorun DONE. [ 1.053255] EXT4-fs (sda1): INFO: recovery required on readonly filesystem [ 1.054409] EXT4-fs (sda1): write access will be enabled during recovery [ 1.275871] EXT4-fs (sda1): orphan cleanup on readonly fs [ 1.308237] EXT4-fs (sda1): 46 orphan inodes deleted [ 1.309040] EXT4-fs (sda1): recovery complete [ 1.316633] EXT4-fs (sda1): mounted filesystem with ordered data mode. Opts: (null) [ 1.318084] VFS: Mounted root (ext4 filesystem) readonly on device 8:1. [ 1.320949] devtmpfs: mounted [ 1.322816] Freeing unused decrypted memory: 2040K [ 1.324787] Freeing unused kernel image memory: 2588K [ 1.330618] Write protecting the kernel read-only data: 22528k [ 1.332554] Freeing unused kernel image memory: 2016K [ 1.334209] Freeing unused kernel image memory: 1708K [ 1.343415] x86/mm: Checked W+X mappings: passed, no W+X pages found. [ 1.344485] x86/mm: Checking user space page tables [ 1.353551] x86/mm: Checked W+X mappings: passed, no W+X pages found. [ 1.354589] Run /sbin/init as init process [ 1.518109] systemd[1]: Failed to insert module 'autofs4': No such file or directory [ 1.539984] systemd[1]: systemd 237 running in system mode. (+PAM +AUDIT +SELINUX +IMA +APPARMOR +SMACK +SYSVINIT +UTMP +LIBCRYPTSETUP +GCRYPT +GNUTLS +ACL +XZ +LZ4 +SECCOMP +BLKID +ELFUTILS +KMOD -IDN2 +IDN -PCRE2 default-hierarchy=hybrid) [ 1.543379] systemd[1]: Detected virtualization kvm. [ 1.544288] systemd[1]: Detected architecture x86-64. Welcome to Ubuntu 18.04.3 LTS! [ 1.569122] systemd[1]: Set hostname to . [ 3.376067] systemd[1]: sysinit.target: Found ordering cycle on cloud-init.service/start [ 3.378793] systemd[1]: sysinit.target: Found dependency on systemd-networkd-wait-online.service/start [ 3.380992] systemd[1]: sysinit.target: Found dependency on systemd-networkd.service/start [ 3.383139] systemd[1]: sysinit.target: Found dependency on network-pre.target/start [ 3.384736] systemd[1]: sysinit.target: Found dependency on firewalld.service/start [ 3.386467] systemd[1]: sysinit.target: Found dependency on basic.target/start [ SKIP ] Ordering cycle found, skipping Init…nit job (metadata service crawler) [ OK ] Started Forward Password Requests to Wall Directory Watch. [ OK ] Started Dispatch Password Requests to Console Directory Watch. [ OK ] Reached target System Time Synchronized. [UNSUPP] Starting of Arbitrary Executable Fi…tem Automount Point not supported. [ OK ] Reached target Local Encrypted Volumes. [ OK ] Created slice User and Session Slice. [ OK ] Created slice System Slice. [ OK ] Listening on Journal Socket. Mounting POSIX Message Queue File System... [ OK ] Listening on Journal Socket (/dev/log). Starting Load Kernel Modules... Starting Create list of required st…ce nodes for the current kernel... [ 3.525241] Loading iSCSI transport class v2.0-870. Mounting Kernel Debug File System... [ OK ] Listening on Network Service Netlink Socket. [ OK ] Created slice system-postfix.slice. [ 3.541250] iscsi: registered transport (tcp) [ OK ] Listening on LVM2 metadata daemon socket. [ OK ] Listening on Device-mapper event daemon FIFOs. Starting Monitoring of LVM2 mirrors…ng dmeventd or progress polling... [ 3.575328] iscsi: registered transport (iser) Starting Remount Root and Kernel File Systems... [ OK ] Created slice system-getty.slice. [ OK ] Listening on /dev/initctl Compatibility Named Pipe. [ OK ] Listening on LVM2 poll daemon socket. [ OK ] Listening on Syslog Socket. [ OK ] Listening on udev Kernel Socket. [ 3.622640] EXT4-fs (sda1): re-mounted. Opts: quota,grpquota,usrquota Mounting Huge Pages File System... [ OK ] Listening on Journal Audit Socket. Starting Journal Service... [ OK ] Created slice system-serial\x2dgetty.slice. [ OK ] Listening on udev Control Socket. [ OK ] Reached target Slices. Starting udev Coldplug all Devices... [ OK ] Started Journal Service. [ OK ] Mounted POSIX Message Queue File System. [ OK ] Started Load Kernel Modules. [ OK ] Started Create list of required sta…vice nodes for the current kernel. [ OK ] Mounted Kernel Debug File System. [ OK ] Started Remount Root and Kernel File Systems. [ OK ] Mounted Huge Pages File System. [ OK ] Started LVM2 metadata daemon. Starting Load/Save Random Seed... Activating swap /var/swap... Starting Initial cloud-init job (pre-networking)... Starting File System Quota Check... Starting Create Static Device Nodes in /dev... Mounting FUSE Control File System... Mounting Kernel Configuration File System... Starting Apply Kernel Variables... Starting Flush Journal to Persistent Storage... [ OK ] Started udev Coldplug all Devices. [ OK ] Started Load/Save Random Seed. [ OK ] Started File System Quota Check. [ OK ] Mounted FUSE Control File System. [ OK ] Mounted Kernel Configuration File System. Starting Enable File System Quotas... [ 3.911072] systemd-journald[214]: Received request to flush runtime journal from PID 1 [ 3.975070] Adding 4194300k swap on /var/swap. Priority:-2 extents:28 across:14442492k FS [ OK ] Activated swap /var/swap. [ OK ] Reached target Swap. [ 4.007469] systemd-journald[214]: File /var/log/journal/e6ee4ecad9b6ece7f9dac46fedb359d8/system.journal corrupted or uncleanly shut down, renaming and replacing. [ OK ] Started Create Static Device Nodes in /dev. Starting udev Kernel Device Manager... [ OK ] Started Apply Kernel Variables. [FAILED] Failed to start Enable File System Quotas. See 'systemctl status quotaon.service' for details. [ OK ] Started Flush Journal to Persistent Storage. [ OK ] Started udev Kernel Device Manager. [ OK ] Found device /dev/ttyS0. [ OK ] Listening on Load/Save RF Kill Switch Status /dev/rfkill Watch. [ OK ] Found device PersistentDisk UEFI. [ OK ] Started Monitoring of LVM2 mirrors,…sing dmeventd or progress polling. [ OK ] Reached target Local File Systems (Pre). Mounting /home/chroot/157239020012646/home/mnemonicsmedia... Mounting /home/chroot/157239028114118/home/hostedUser... Mounting /boot/efi... Mounting Mount unit for core, revision 8039... Mounting Mount unit for core, revision 7917... Mounting Mount unit for google-cloud-sdk, revision 106... Mounting /home/chroot/15723901229425/home/tchl... Mounting Mount unit for google-cloud-sdk, revision 107... [ OK ] Mounted /home/chroot/157239020012646/home/mnemonicsmedia. [ OK ] Mounted /home/chroot/157239028114118/home/hostedUser. [ OK ] Mounted /boot/efi. [ OK ] Mounted Mount unit for core, revision 8039. [ OK ] Mounted Mount unit for core, revision 7917. [ OK ] Mounted Mount unit for google-cloud-sdk, revision 106. [ OK ] Mounted /home/chroot/15723901229425/home/tchl. [ OK ] Mounted Mount unit for google-cloud-sdk, revision 107. [ OK ] Reached target Local File Systems. Starting Create Volatile Files and Directories... Starting AppArmor initialization... [ OK ] Started Create Volatile Files and Directories. Starting Update UTMP about System Boot/Shutdown... [ OK ] Started Update UTMP about System Boot/Shutdown. [ OK ] Started AppArmor initialization. [ 7.854214] cloud-init[221]: Cloud-init v. 19.2-36-g059d049c-0ubuntu2~18.04.1 running 'init-local' at Sat, 16 Nov 2019 22:42:20 +0000. Up 7.80 seconds. [ 7.868640] cloud-init[221]: 2019-11-16 22:42:20,567 - util.py[WARNING]: failed stage init-local [ 7.880648] cloud-init[221]: failed run of stage init-local [ 7.882065] cloud-init[221]: ------------------------------------------------------------ [ 7.892587] cloud-init[221]: Traceback (most recent call last): [ 7.904615] cloud-init[221]: File "/usr/lib/python3/dist-packages/cloudinit/cmd/main.py", line 653, in status_wrapper [ 7.916631] cloud-init[221]: ret = functor(name, args) [FAILED] Failed to start Initial cloud-init job (pre-networking). See 'systemctl status cloud-init-local.service' for details. [ OK ] Reached target System Initialization. [ 7.931404] cloud-init[221]: File "/usr/lib/python3/dist-packages/cloudinit/cmd/main.py", line 323, in main_init Starting LXD - unix socket. [ 7.969932] cloud-init[221]: init.fetch(existing=existing) [ OK ] Started Discard unused blocks once a week. [ OK ] Started Daily Cleanup of Temporary Directories. [ OK ] Listening on Open-iSCSI iscsid Socket. [ OK ] Listening on D-Bus System Message Bus Socket. [ OK ] Started Clean PHP session files every 30 mins. [ 7.995859] cloud-init[221]: File "/usr/lib/python3/dist-packages/cloudinit/stages.py", line 352, in fetch [ 8.059909] cloud-init[221]: return self._get_data_source(existing=existing) [ 8.061620] cloud-init[221]: File "/usr/lib/python3/dist-packages/cloudinit/stages.py", line 253, in _get_data_source [ 8.063897] cloud-init[221]: util.del_file(self.paths.instance_link) Starting Socket activation for snappy daemon. [ OK ] Listening on ACPID Listen Socket. [ OK ] Started Daily apt download activities. [ OK ] Started Daily apt upgrade and clean activities. [ 8.079891] cloud-init[221]: File "/usr/lib/python3/dist-packages/cloudinit/util.py", line 1780, in del_file [ 8.136632] cloud-init[221]: raise e [ 8.148691] cloud-init[221]: File "/usr/lib/python3/dist-packages/cloudinit/util.py", line 1777, in del_file [ OK ] Started Message of the Day. [ OK ] Reached target Timers. [ 8.161972] cloud-init[221]: os.unlink(path) [ 8.196696] cloud-init[221]: IsADirectoryError: [Errno 21] Is a directory: '/var/lib/cloud/instance' [ 8.208672] cloud-init[221]: ------------------------------------------------------------ [ OK ] Started ACPI Events Check. [ OK ] Reached target Paths. [ OK ] Reached target Cloud-config availability. [ OK ] Listening on LXD - unix socket. [ OK ] Listening on Socket activation for snappy daemon. [ OK ] Reached target Sockets. [ OK ] Reached target Basic System. [ OK ] Started D-Bus System Message Bus. Starting Login Service... Starting firewalld - dynamic firewall daemon... [ OK ] Started Regular background program processing daemon. [ OK ] Started ClamAV virus database updater. Starting Clam AntiVirus userspace daemon... Starting SSHGuard... Starting System Logging Service... Starting Clean php session files... [ OK ] Started Deferred execution scheduler. Starting LSB: Record successful boot for GRUB... Started bpfilter Starting Snappy daemon... Starting Dispatcher daemon for systemd-networkd... [ OK ] Started FUSE filesystem for LXC. Starting LXD - container startup/shutdown... [ OK ] Started Clam AntiVirus userspace daemon. [ OK ] Started Login Service. [ OK ] Started SSHGuard. [ OK ] Started LSB: Record successful boot for GRUB. [ OK ] Started System Logging Service. Nov 16 17:42:22 node1 systemd-modules-load[201]: Inserted module 'iscsi_tcp' Nov 16 17:42:22 node1 systemd-modules-load[201]: Inserted module 'ib_iser' Nov 16 17:42:22 node1 systemd[1]: Mounted POSIX Message Queue File System. Nov 16 17:42:22 node1 systemd[1]: Started Load Kernel Modules. Nov 16 17:42:22 node1 systemd[1]: Started Create list of required static device nodes for the current kernel. Nov 16 17:42:22 node1 systemd[1]: Mounted Kernel Debug File System. Nov 16 17:42:22 node1 systemd[1]: Started Remount Root and Kernel File Systems. Nov 16 17:42:22 node1 systemd[1]: Mounted Huge Pages File System. Nov 16 17:42:22 node1 systemd[1]: Started LVM2 metadata daemon. Nov 16 17:42:22 node1 systemd[1]: Starting Load/Save Random Seed... Nov 16 17:42:22 node1 systemd[1]: Activating swap /var/swap... Nov 16 17:42:22 node1 swapon[220]: swapon: /var/swap: insecure permissions 0644, 0600 suggested. Nov 16 17:42:22 node1 systemd[1]: Starting Initial cloud-init job (pre-networking)... Nov 16 17:42:22 node1 systemd[1]: Starting File System Quota Check... Nov 16 17:42:22 node1 systemd[1]: Starting Create Static Device Nodes in /dev... Nov 16 17:42:22 node1 systemd[1]: Mounting FUSE Control File System... Nov 16 17:42:22 node1 systemd[1]: Mounting Kernel Configuration File System... Nov 16 17:42:22 node1 systemd[1]: Starting Apply Kernel Variables... Nov 16 17:42:22 node1 systemd[1]: Starting Flush Journal to Persistent Storage... Nov 16 17:42:22 node1 systemd[1]: Started udev Coldplug all Devices. Nov 16 17:42:22 node1 systemd[1]: Started Load/Save Random Seed. Nov 16 17:42:22 node1 systemd[1]: Started File System Quota Check. Nov 16 17:42:22 node1 systemd[1]: Mounted FUSE Control File System. Nov 16 17:42:22 node1 systemd[1]: Mounted Kernel Configuration File System. Nov 16 17:42:22 node1 systemd[1]: Starting Enable File System Quotas... Nov 16 17:42:22 node1 systemd[1]: Activated swap /var/swap. Nov 16 17:42:22 node1 quotaon[228]: quotaon: using //aquota.group on /dev/root [/]: No such process Nov 16 17:42:22 node1 quotaon[228]: quotaon: Quota format not supported in kernel. Nov 16 17:42:22 node1 quotaon[228]: quotaon: using //aquota.user on /dev/root [/]: No such process Nov 16 17:42:22 node1 quotaon[228]: quotaon: Quota format not supported in kernel. Nov 16 17:42:22 node1 systemd[1]: Reached target Swap. Nov 16 17:42:22 node1 systemd[1]: Started Create Static Device Nodes in /dev. Nov 16 17:42:22 node1 systemd[1]: Starting udev Kernel Device Manager... Nov 16 17:42:22 node1 systemd[1]: Started Apply Kernel Variables. Nov 16 17:42:22 node1 systemd[1]: quotaon.service: Main process exited, code=exited, status=2/INVALIDARGUMENT Nov 16 17:42:22 node1 systemd[1]: quotaon.service: Failed with result 'exit-code'. Nov 16 17:42:22 node1 systemd[1]: Failed to start Enable File System Quotas. Nov 16 17:42:22 node1 systemd[1]: Started Flush Journal to Persistent Storage. Nov 16 17:42:22 node1 systemd[1]: Started udev Kernel Device Manager. Nov 16 17:42:22 node1 systemd[1]: Found device /dev/ttyS0. Nov 16 17:42:22 node1 systemd-udevd[243]: link_config: autonegotiation is unset or enabled, the speed and duplex are not writable. Nov 16 17:42:22 node1 systemd[1]: Listening on Load/Save RF Kill Switch Status /dev/rfkill Watch. Nov 16 17:42:22 node1 systemd-udevd[235]: link_config: autonegotiation is unset or enabled, the speed and duplex are not writable. Nov 16 17:42:22 node1 systemd-udevd[236]: error opening ATTR{/sys/devices/pci0000:00/0000:00:03.0/virtio0/host0/target0:0:1/0:0:1:0/block/sda/sda1/queue/scheduler} for writing: No such file or directory Nov 16 17:42:22 node1 systemd-udevd[235]: error opening ATTR{/sys/devices/pci0000:00/0000:00:03.0/virtio0/host0/target0:0:1/0:0:1:0/block/sda/sda15/queue/scheduler} for writing: No such file or directory Nov 16 17:42:22 node1 systemd[1]: Found device PersistentDisk UEFI. Nov 16 17:42:22 node1 systemd-udevd[241]: error opening ATTR{/sys/devices/pci0000:00/0000:00:03.0/virtio0/host0/target0:0:1/0:0:1:0/block/sda/sda14/queue/scheduler} for writing: No such file or directory Nov 16 17:42:22 node1 systemd[1]: Started Monitoring of LVM2 mirrors, snapshots etc. using dmeventd or progress polling. Nov 16 17:42:22 node1 systemd[1]: Reached target Local File Systems (Pre). Nov 16 17:42:22 node1 systemd[1]: Mounting /home/chroot/157239020012646/home/mnemonicsmedia... Nov 16 17:42:22 node1 systemd[1]: Mounting /home/chroot/157239028114118/home/hostedUser... Nov 16 17:42:22 node1 systemd[1]: Mounting /boot/efi... Nov 16 17:42:22 node1 systemd[1]: Mounting Mount unit for core, revision 8039... Nov 16 17:42:22 node1 systemd[1]: Mounting Mount unit for core, revision 7917... Nov 16 17:42:22 node1 systemd[1]: Mounting Mount unit for google-cloud-sdk, revision 106... Nov 16 17:42:22 node1 systemd[1]: Mounting /home/chroot/15723901229425/home/tchl... Nov 16 17:42:22 node1 systemd[1]: Mounting Mount unit for google-cloud-sdk, revision 107... Nov 16 17:42:22 node1 systemd[1]: Mounted /home/chroot/157239020012646/home/mnemonicsmedia. Nov 16 17:42:22 node1 systemd[1]: Mounted /home/chroot/157239028114118/home/hostedUser. Nov 16 17:42:22 node1 systemd[1]: Mounted /boot/efi. Nov 16 17:42:22 node1 systemd[1]: Mounted Mount unit for core, revision 8039. Nov 16 17:42:22 node1 systemd[1]: Mounted Mount unit for core, revision 7917. Nov 16 17:42:22 node1 systemd[1]: Mounted Mount unit for google-cloud-sdk, revision 106. Nov 16 17:42:22 node1 systemd[1]: Mounted /home/chroot/15723901229425/home/tchl. Nov 16 17:42:22 node1 systemd[1]: Mounted Mount unit for google-cloud-sdk, revision 107. Nov 16 17:42:22 node1 systemd[1]: Reached target Local File Systems. Nov 16 17:42:22 node1 systemd[1]: Starting Create Volatile Files and Directories... Nov 16 17:42:22 node1 systemd[1]: Starting AppArmor initialization... Nov 16 17:42:22 node1 apparmor[374]: * Starting AppArmor profiles Nov 16 17:42:22 node1 systemd[1]: Started Create Volatile Files and Directories. Nov 16 17:42:22 node1 systemd[1]: Starting Update UTMP about System Boot/Shutdown... Nov 16 17:42:22 node1 systemd[1]: Started Update UTMP about System Boot/Shutdown. Nov 16 17:42:22 node1 apparmor[374]: Skipping profile in /etc/apparmor.d/disable: usr.sbin.rsyslogd Nov 16 17:42:22 node1 apparmor[374]: ...done. Nov 16 17:42:22 node1 systemd[1]: Started AppArmor initialization. Nov 16 17:42:22 node1 cloud-init[221]: Cloud-init v. 19.2-36-g059d049c-0ubuntu2~18.04.1 running 'init-local' at Sat, 16 Nov 2019 22:42:20 +0000. Up 7.80 seconds. Nov 16 17:42:22 node1 cloud-init[221]: 2019-11-16 22:42:20,567 - util.py[WARNING]: failed stage init-local Nov 16 17:42:22 node1 cloud-init[221]: failed run of stage init-local Nov 16 17:42:22 node1 cloud-init[221]: ------------------------------------------------------------ Nov 16 17:42:22 node1 cloud-init[221]: Traceback (most recent call last): Nov 16 17:42:22 node1 cloud-init[221]: File "/usr/lib/python3/dist-packages/cloudinit/cmd/main.py", line 653, in status_wrapper Nov 16 17:42:22 node1 cloud-init[221]: ret = functor(name, args) Nov 16 17:42:22 node1 cloud-init[221]: File "/usr/lib/python3/dist-packages/cloudinit/cmd/main.py", line 323, in main_init Nov 16 17:42:22 node1 cloud-init[221]: init.fetch(existing=existing) Nov 16 17:42:22 node1 cloud-init[221]: File "/usr/lib/python3/dist-packages/cloudinit/stages.py", line 352, in fetch Nov 16 17:42:22 node1 cloud-init[221]: return self._get_data_source(existing=existing) Nov 16 17:42:22 node1 cloud-init[221]: File "/usr/lib/python3/dist-packages/cloudinit/stages.py", line 253, in _get_data_source Nov 16 17:42:22 node1 cloud-init[221]: util.del_file(self.paths.instance_link) Nov 16 17:42:22 node1 cloud-init[221]: File "/usr/lib/python3/dist-packages/cloudinit/util.py", line 1780, in del_file Nov 16 17:42:22 node1 cloud-init[221]: raise e Nov 16 17:42:22 node1 cloud-init[221]: File "/usr/lib/python3/dist-packages/cloudinit/util.py", line 1777, in del_file Nov 16 17:42:22 node1 cloud-init[221]: os.unlink(path) Nov 16 17:42:22 node1 cloud-init[221]: IsADirectoryError: [Errno 21] Is a directory: '/var/lib/cloud/instance' Nov 16 17:42:22 node1 cloud-init[221]: ------------------------------------------------------------ Nov 16 17:42:22 node1 systemd[1]: cloud-init-local.service: Main process exited, code=exited, status=1/FAILURE Nov 16 17:42:22 node1 systemd[1]: cloud-init-local.service: Failed with result 'exit-code'. Nov 16 17:42:22 node1 systemd[1]: Failed to start Initial cloud-init job (pre-networking). Nov 16 17:42:22 node1 systemd[1]: Reached target System Initialization. Nov 16 17:42:22 node1 systemd[1]: Starting LXD - unix socket. Nov 16 17:42:22 node1 systemd[1]: Started Discard unused blocks once a week. Nov 16 17:42:22 node1 systemd[1]: Started Daily Cleanup of Temporary Directories. Nov 16 17:42:22 node1 systemd[1]: Listening on Open-iSCSI iscsid Socket. Nov 16 17:42:22 node1 systemd[1]: Listening on D-Bus System Message Bus Socket. Nov 16 17:42:22 node1 systemd[1]: Started Clean PHP session files every 30 mins. Nov 16 17:42:22 node1 systemd[1]: Starting Socket activation for snappy daemon. Nov 16 17:42:22 node1 systemd[1]: Listening on ACPID Listen Socket. Nov 16 17:42:22 node1 systemd[1]: Started Daily apt download activities. Nov 16 17:42:22 node1 systemd[1]: Started Daily apt upgrade and clean activities. Nov 16 17:42:22 node1 systemd[1]: Started Message of the Day. Nov 16 17:42:22 node1 systemd[1]: Reached target Timers. Nov 16 17:42:22 node1 systemd[1]: Started ACPI Events Check. Nov 16 17:42:22 node1 systemd[1]: Reached target Paths. Nov 16 17:42:22 node1 systemd[1]: Reached target Cloud-config availability. Nov 16 17:42:22 node1 systemd[1]: Listening on LXD - unix socket. Nov 16 17:42:22 node1 systemd[1]: Listening on Socket activation for snappy daemon. Nov 16 17:42:22 node1 systemd[1]: Reached target Sockets. Nov 16 17:42:22 node1 systemd[1]: Reached target Basic System. Nov 16 17:42:22 node1 systemd[1]: Started D-Bus System Message Bus. Nov 16 17:42:22 node1 dbus-daemon[518]: [system] AppArmor D-Bus mediation is enabled Nov 16 17:42:22 node1 systemd[1]: Starting Login Service... Nov 16 17:42:22 node1 systemd[1]: Starting firewalld - dynamic firewall daemon... Nov 16 17:42:22 node1 systemd[1]: Started Regular background program processing daemon. Nov 16 17:42:22 node1 systemd[1]: Started ClamAV virus database updater. Nov 16 17:42:22 node1 systemd[1]: Starting Clam AntiVirus userspace daemon... Nov 16 17:42:22 node1 systemd[1]: Starting SSHGuard... Nov 16 17:42:22 node1 systemd[1]: Starting System Logging Service... Nov 16 17:42:22 node1 systemd[1]: Starting Clean php session files... Nov 16 17:42:22 node1 systemd[1]: Started Deferred execution scheduler. Nov 16 17:42:22 node1 systemd[1]: Starting LSB: Record successful boot for GRUB... Nov 16 17:42:22 node1 systemd[1]: Starting Snappy daemon... Nov 16 17:42:22 node1 systemd[1]: Starting Dispatcher daemon for systemd-networkd... Nov 16 17:42:22 node1 systemd[1]: Started FUSE filesystem for LXC. Nov 16 17:42:22 node1 systemd[1]: Starting LXD - container startup/shutdown... Nov 16 17:42:22 node1 systemd[1]: Started Clam AntiVirus userspace daemon. Nov 16 17:42:22 node1 grub-common[552]: * Recording successful boot for GRUB Nov 16 17:42:22 node1 lxcfs[555]: mount namespace: 5 Nov 16 17:42:22 node1 lxcfs[555]: hierarchies: Nov 16 17:42:22 node1 lxcfs[555]: 0: fd: 6: perf_event Nov 16 17:42:22 node1 lxcfs[555]: 1: fd: 7: pids Nov 16 17:42:22 node1 lxcfs[555]: 2: fd: 8: blkio Nov 16 17:42:22 node1 lxcfs[555]: 3: fd: 9: memory Nov 16 17:42:22 node1 lxcfs[555]: 4: fd: 10: cpu,cpuacct Nov 16 17:42:22 node1 lxcfs[555]: 5: fd: 11: freezer Nov 16 17:42:22 node1 lxcfs[555]: 6: fd: 12: cpuset Nov 16 17:42:22 node1 lxcfs[555]: 7: fd: 13: rdma Nov 16 17:42:22 node1 lxcfs[555]: 8: fd: 14: devices Nov 16 17:42:22 node1 lxcfs[555]: 9: fd: 15: hugetlb Nov 16 17:42:22 node1 lxcfs[555]: 10: fd: 16: net_cls,net_prio Nov 16 17:42:22 node1 lxcfs[555]: 11: fd: 17: name=systemd Nov 16 17:42:22 node1 lxcfs[555]: 12: fd: 18: unified Nov 16 17:42:22 node1 systemd[1]: Started Login Service. Nov 16 17:42:22 node1 systemd[1]: Started SSHGuard. Nov 16 17:42:22 node1 grub-common[552]: ...done. Nov 16 17:42:22 node1 systemd[1]: Started LSB: Record successful boot for GRUB. Nov 16 17:42:22 node1 sshguard-journalctl[604]: Chain INPUT (policy ACCEPT) Nov 16 17:42:22 node1 sshguard-journalctl[604]: target prot opt source destination Nov 16 17:42:22 node1 sshguard-journalctl[604]: sshguard all -- 0.0.0.0/0 0.0.0.0/0 Nov 16 17:42:22 node1 sshguard-journalctl[604]: Chain FORWARD (policy ACCEPT) Nov 16 17:42:22 node1 sshguard-journalctl[604]: target prot opt source destination Nov 16 17:42:22 node1 sshguard-journalctl[604]: Chain OUTPUT (policy ACCEPT) Nov 16 17:42:22 node1 sshguard-journalctl[604]: target prot opt source destination Nov 16 17:42:22 node1 sshguard-journalctl[604]: Chain sshguard (1 references) Nov 16 17:42:22 node1 sshguard-journalctl[604]: target prot opt source destination Nov 16 17:42:22 node1 systemd[1]: Started System Logging Service. Nov 16 17:42:22 node1 kernel: [ 0.000000] Linux version 5.0.0-1025-gcp (buildd@lcy01-amd64-001) (gcc version 7.4.0 (Ubuntu 7.4.0-1ubuntu1~18.04.1)) #26~18.04.1-Ubuntu SMP Mon Nov 11 13:09:18 UTC 2019 (Ubuntu 5.0.0-1025.26~18.04.1-gcp 5.0.21) Nov 16 17:42:22 node1 kernel: [ 0.000000] Command line: BOOT_IMAGE=/boot/vmlinuz-5.0.0-1025-gcp root=PARTUUID=a0d4cd9e-2a82-428c-af79-d684141d2d98 ro scsi_mod.use_blk_mq=Y console=ttyS0 Nov 16 17:42:22 node1 kernel: [ 0.000000] KERNEL supported cpus: Nov 16 17:42:22 node1 kernel: [ 0.000000] Intel GenuineIntel Nov 16 17:42:22 node1 kernel: [ 0.000000] AMD AuthenticAMD Nov 16 17:42:22 node1 kernel: [ 0.000000] Hygon HygonGenuine Nov 16 17:42:22 node1 kernel: [ 0.000000] Centaur CentaurHauls Nov 16 17:42:22 node1 kernel: [ 0.000000] x86/fpu: Supporting XSAVE feature 0x001: 'x87 floating point registers' Nov 16 17:42:22 node1 kernel: [ 0.000000] x86/fpu: Supporting XSAVE feature 0x002: 'SSE registers' Nov 16 17:42:22 node1 kernel: [ 0.000000] x86/fpu: Supporting XSAVE feature 0x004: 'AVX registers' Nov 16 17:42:22 node1 kernel: [ 0.000000] x86/fpu: Supporting XSAVE feature 0x008: 'MPX bounds registers' Nov 16 17:42:22 node1 kernel: [ 0.000000] x86/fpu: Supporting XSAVE feature 0x010: 'MPX CSR' Nov 16 17:42:22 node1 kernel: [ 0.000000] x86/fpu: Supporting XSAVE feature 0x020: 'AVX-512 opmask' Nov 16 17:42:22 node1 kernel: [ 0.000000] x86/fpu: Supporting XSAVE feature 0x040: 'AVX-512 Hi256' Nov 16 17:42:22 node1 kernel: [ 0.000000] x86/fpu: Supporting XSAVE feature 0x080: 'AVX-512 ZMM_Hi256' Nov 16 17:42:22 node1 kernel: [ 0.000000] x86/fpu: xstate_offset[2]: 576, xstate_sizes[2]: 256 Nov 16 17:42:22 node1 kernel: [ 0.000000] x86/fpu: xstate_offset[3]: 832, xstate_sizes[3]: 64 Nov 16 17:42:22 node1 kernel: [ 0.000000] x86/fpu: xstate_offset[4]: 896, xstate_sizes[4]: 64 Nov 16 17:42:22 node1 kernel: [ 0.000000] x86/fpu: xstate_offset[5]: 960, xstate_sizes[5]: 64 Nov 16 17:42:22 node1 kernel: [ 0.000000] x86/fpu: xstate_offset[6]: 1024, xstate_sizes[6]: 512 Nov 16 17:42:22 node1 kernel: [ 0.000000] x86/fpu: xstate_offset[7]: 1536, xstate_sizes[7]: 1024 Nov 16 17:42:22 node1 kernel: [ 0.000000] x86/fpu: Enabled xstate features 0xff, context size is 2560 bytes, using 'compacted' format. Nov 16 17:42:22 node1 kernel: [ 0.000000] BIOS-provided physical RAM map: Nov 16 17:42:22 node1 kernel: [ 0.000000] BIOS-e820: [mem 0x0000000000000000-0x000000000009fbff] usable Nov 16 17:42:22 node1 kernel: [ 0.000000] BIOS-e820: [mem 0x000000000009fc00-0x000000000009ffff] reserved Nov 16 17:42:22 node1 kernel: [ 0.000000] BIOS-e820: [mem 0x00000000000f0000-0x00000000000fffff] reserved Nov 16 17:42:22 node1 kernel: [ 0.000000] BIOS-e820: [mem 0x0000000000100000-0x00000000bfffcfff] usable Nov 16 17:42:22 node1 kernel: [ 0.000000] BIOS-e820: [mem 0x00000000bfffd000-0x00000000bfffffff] reserved Nov 16 17:42:22 node1 kernel: [ 0.000000] BIOS-e820: [mem 0x00000000fffbc000-0x00000000ffffffff] reserved Nov 16 17:42:22 node1 kernel: [ 0.000000] BIOS-e820: [mem 0x0000000100000000-0x000000012fffffff] usable Nov 16 17:42:22 node1 kernel: [ 0.000000] NX (Execute Disable) protection: active Nov 16 17:42:22 node1 kernel: [ 0.000000] SMBIOS 2.4 present. Nov 16 17:42:22 node1 kernel: [ 0.000000] DMI: Google Google Compute Engine/Google Compute Engine, BIOS Google 01/01/2011 Nov 16 17:42:22 node1 kernel: [ 0.000000] Hypervisor detected: KVM Nov 16 17:42:22 node1 kernel: [ 0.000000] kvm-clock: Using msrs 4b564d01 and 4b564d00 Nov 16 17:42:22 node1 kernel: [ 0.000000] kvm-clock: cpu 0, msr 59a01001, primary cpu clock Nov 16 17:42:22 node1 kernel: [ 0.000000] kvm-clock: using sched offset of 1316960935 cycles Nov 16 17:42:22 node1 kernel: [ 0.000002] clocksource: kvm-clock: mask: 0xffffffffffffffff max_cycles: 0x1cd42e4dffb, max_idle_ns: 881590591483 ns Nov 16 17:42:22 node1 kernel: [ 0.000004] tsc: Detected 2000.156 MHz processor Nov 16 17:42:22 node1 kernel: [ 0.000595] e820: update [mem 0x00000000-0x00000fff] usable ==> reserved Nov 16 17:42:22 node1 kernel: [ 0.000597] e820: remove [mem 0x000a0000-0x000fffff] usable Nov 16 17:42:22 node1 kernel: [ 0.000600] last_pfn = 0x130000 max_arch_pfn = 0x400000000 Nov 16 17:42:22 node1 kernel: [ 0.000643] MTRR default type: write-back Nov 16 17:42:22 node1 kernel: [ 0.000644] MTRR fixed ranges enabled: Nov 16 17:42:22 node1 kernel: [ 0.000645] 00000-9FFFF write-back Nov 16 17:42:22 node1 kernel: [ 0.000646] A0000-BFFFF uncachable Nov 16 17:42:22 node1 kernel: [ 0.000647] C0000-FFFFF write-protect Nov 16 17:42:22 node1 kernel: [ 0.000647] MTRR variable ranges enabled: Nov 16 17:42:22 node1 kernel: [ 0.000648] 0 base 0000C0000000 mask 3FFFC0000000 uncachable Nov 16 17:42:22 node1 kernel: [ 0.000649] 1 disabled Nov 16 17:42:22 node1 kernel: [ 0.000649] 2 disabled Nov 16 17:42:22 node1 kernel: [ 0.000650] 3 disabled Nov 16 17:42:22 node1 kernel: [ 0.000650] 4 disabled Nov 16 17:42:22 node1 kernel: [ 0.000650] 5 disabled Nov 16 17:42:22 node1 kernel: [ 0.000651] 6 disabled Nov 16 17:42:22 node1 kernel: [ 0.000651] 7 disabled Nov 16 17:42:22 node1 kernel: [ 0.000664] x86/PAT: Configuration [0-7]: WB WC UC- UC WB WP UC- WT Nov 16 17:42:22 node1 kernel: [ 0.000675] last_pfn = 0xbfffd max_arch_pfn = 0x400000000 Nov 16 17:42:22 node1 kernel: [ 0.005074] found SMP MP-table at [mem 0x000f2ac0-0x000f2acf] Nov 16 17:42:22 node1 kernel: [ 0.005171] check: Scanning 1 areas for low memory corruption Nov 16 17:42:22 node1 kernel: [ 0.005205] Using GB pages for direct mapping Nov 16 17:42:22 node1 kernel: [ 0.005209] BRK [0x59c01000, 0x59c01fff] PGTABLE Nov 16 17:42:22 node1 kernel: [ 0.005213] BRK [0x59c02000, 0x59c02fff] PGTABLE Nov 16 17:42:22 node1 kernel: [ 0.005213] BRK [0x59c03000, 0x59c03fff] PGTABLE Nov 16 17:42:22 node1 kernel: [ 0.005244] BRK [0x59c04000, 0x59c04fff] PGTABLE Nov 16 17:42:22 node1 kernel: [ 0.005246] BRK [0x59c05000, 0x59c05fff] PGTABLE Nov 16 17:42:22 node1 kernel: [ 0.006131] ACPI: Early table checksum verification disabled Nov 16 17:42:22 node1 kernel: [ 0.006182] ACPI: RSDP 0x00000000000F2870 000014 (v00 Google) Nov 16 17:42:22 node1 kernel: [ 0.006186] ACPI: RSDT 0x00000000BFFFFFA0 000038 (v01 Google GOOGRSDT 00000001 GOOG 00000001) Nov 16 17:42:22 node1 kernel: [ 0.006193] ACPI: FACP 0x00000000BFFFF400 0000F4 (v02 Google GOOGFACP 00000001 GOOG 00000001) Nov 16 17:42:22 node1 kernel: [ 0.006200] ACPI: DSDT 0x00000000BFFFDB40 0018BA (v01 Google GOOGDSDT 00000001 GOOG 00000001) Nov 16 17:42:22 node1 kernel: [ 0.006203] ACPI: FACS 0x00000000BFFFDB00 000040 Nov 16 17:42:22 node1 kernel: [ 0.006207] ACPI: FACS 0x00000000BFFFDB00 000040 Nov 16 17:42:22 node1 kernel: [ 0.006210] ACPI: SRAT 0x00000000BFFFFEC0 0000B8 (v01 Google GOOGSRAT 00000001 GOOG 00000001) Nov 16 17:42:22 node1 kernel: [ 0.006214] ACPI: APIC 0x00000000BFFFFE20 00006E (v01 Google GOOGAPIC 00000001 GOOG 00000001) Nov 16 17:42:22 node1 kernel: [ 0.006217] ACPI: SSDT 0x00000000BFFFF500 00091F (v01 Google GOOGSSDT 00000001 GOOG 00000001) Nov 16 17:42:22 node1 kernel: [ 0.006221] ACPI: WAET 0x00000000BFFFFE90 000028 (v01 Google GOOGWAET 00000001 GOOG 00000001) Nov 16 17:42:22 node1 kernel: [ 0.006230] ACPI: Local APIC address 0xfee00000 Nov 16 17:42:22 node1 kernel: [ 0.006312] SRAT: PXM 0 -> APIC 0x00 -> Node 0 Nov 16 17:42:22 node1 kernel: [ 0.006317] ACPI: SRAT: Node 0 PXM 0 [mem 0x00000000-0x0009ffff] Nov 16 17:42:22 node1 kernel: [ 0.006319] ACPI: SRAT: Node 0 PXM 0 [mem 0x00100000-0xbfffffff] Nov 16 17:42:22 node1 kernel: [ 0.006321] ACPI: SRAT: Node 0 PXM 0 [mem 0x100000000-0x12fffffff] Nov 16 17:42:22 node1 kernel: [ 0.006325] NUMA: Node 0 [mem 0x00000000-0x0009ffff] + [mem 0x00100000-0xbfffffff] -> [mem 0x00000000-0xbfffffff] Nov 16 17:42:22 node1 kernel: [ 0.006328] NUMA: Node 0 [mem 0x00000000-0xbfffffff] + [mem 0x100000000-0x12fffffff] -> [mem 0x00000000-0x12fffffff] Nov 16 17:42:22 node1 kernel: [ 0.006340] NODE_DATA(0) allocated [mem 0x12ffd3000-0x12fffdfff] Nov 16 17:42:22 node1 kernel: [ 0.007216] Zone ranges: Nov 16 17:42:22 node1 kernel: [ 0.007217] DMA [mem 0x0000000000001000-0x0000000000ffffff] Nov 16 17:42:22 node1 kernel: [ 0.007218] DMA32 [mem 0x0000000001000000-0x00000000ffffffff] Nov 16 17:42:22 node1 kernel: [ 0.007220] Normal [mem 0x0000000100000000-0x000000012fffffff] Nov 16 17:42:22 node1 kernel: [ 0.007220] Device empty Nov 16 17:42:22 node1 kernel: [ 0.007222] Movable zone start for each node Nov 16 17:42:22 node1 kernel: [ 0.007234] Early memory node ranges Nov 16 17:42:22 node1 kernel: [ 0.007235] node 0: [mem 0x0000000000001000-0x000000000009efff] Nov 16 17:42:22 node1 kernel: [ 0.007236] node 0: [mem 0x0000000000100000-0x00000000bfffcfff] Nov 16 17:42:22 node1 kernel: [ 0.007237] node 0: [mem 0x0000000100000000-0x000000012fffffff] Nov 16 17:42:22 node1 kernel: [ 0.008591] Zeroed struct page in unavailable ranges: 101 pages Nov 16 17:42:22 node1 kernel: [ 0.008592] Initmem setup node 0 [mem 0x0000000000001000-0x000000012fffffff] Nov 16 17:42:22 node1 kernel: [ 0.008594] On node 0 totalpages: 982939 Nov 16 17:42:22 node1 kernel: [ 0.008595] DMA zone: 64 pages used for memmap Nov 16 17:42:22 node1 kernel: [ 0.008595] DMA zone: 21 pages reserved Nov 16 17:42:22 node1 kernel: [ 0.008596] DMA zone: 3998 pages, LIFO batch:0 Nov 16 17:42:22 node1 kernel: [ 0.008691] DMA32 zone: 12224 pages used for memmap Nov 16 17:42:22 node1 kernel: [ 0.008691] DMA32 zone: 782333 pages, LIFO batch:63 Nov 16 17:42:22 node1 kernel: [ 0.040718] Normal zone: 3072 pages used for memmap Nov 16 17:42:22 node1 kernel: [ 0.040720] Normal zone: 196608 pages, LIFO batch:63 Nov 16 17:42:22 node1 kernel: [ 0.049456] ACPI: PM-Timer IO Port: 0xb008 Nov 16 17:42:22 node1 kernel: [ 0.049462] ACPI: Local APIC address 0xfee00000 Nov 16 17:42:22 node1 kernel: [ 0.049481] ACPI: LAPIC_NMI (acpi_id[0xff] dfl dfl lint[0x1]) Nov 16 17:42:22 node1 kernel: [ 0.049578] IOAPIC[0]: apic_id 0, version 17, address 0xfec00000, GSI 0-23 Nov 16 17:42:22 node1 kernel: [ 0.049581] ACPI: INT_SRC_OVR (bus 0 bus_irq 5 global_irq 5 high level) Nov 16 17:42:22 node1 kernel: [ 0.049583] ACPI: INT_SRC_OVR (bus 0 bus_irq 9 global_irq 9 high level) Nov 16 17:42:22 node1 kernel: [ 0.049584] ACPI: INT_SRC_OVR (bus 0 bus_irq 10 global_irq 10 high level) Nov 16 17:42:22 node1 kernel: [ 0.049585] ACPI: INT_SRC_OVR (bus 0 bus_irq 11 global_irq 11 high level) Nov 16 17:42:22 node1 kernel: [ 0.049587] ACPI: IRQ5 used by override. Nov 16 17:42:22 node1 kernel: [ 0.049588] ACPI: IRQ9 used by override. Nov 16 17:42:22 node1 kernel: [ 0.049588] ACPI: IRQ10 used by override. Nov 16 17:42:22 node1 kernel: [ 0.049589] ACPI: IRQ11 used by override. Nov 16 17:42:22 node1 kernel: [ 0.049591] Using ACPI (MADT) for SMP configuration information Nov 16 17:42:22 node1 kernel: [ 0.049594] smpboot: Allowing 1 CPUs, 0 hotplug CPUs Nov 16 17:42:22 node1 kernel: [ 0.049623] PM: Registered nosave memory: [mem 0x00000000-0x00000fff] Nov 16 17:42:22 node1 kernel: [ 0.049626] PM: Registered nosave memory: [mem 0x0009f000-0x0009ffff] Nov 16 17:42:22 node1 kernel: [ 0.049628] PM: Registered nosave memory: [mem 0x000a0000-0x000effff] Nov 16 17:42:22 node1 kernel: [ 0.049630] PM: Registered nosave memory: [mem 0x000f0000-0x000fffff] Nov 16 17:42:22 node1 kernel: [ 0.049632] PM: Registered nosave memory: [mem 0xbfffd000-0xbfffffff] Nov 16 17:42:22 node1 kernel: [ 0.049634] PM: Registered nosave memory: [mem 0xc0000000-0xfffbbfff] Nov 16 17:42:22 node1 kernel: [ 0.049636] PM: Registered nosave memory: [mem 0xfffbc000-0xffffffff] Nov 16 17:42:22 node1 kernel: [ 0.049639] [mem 0xc0000000-0xfffbbfff] available for PCI devices Nov 16 17:42:22 node1 kernel: [ 0.049641] Booting paravirtualized kernel on KVM Nov 16 17:42:22 node1 kernel: [ 0.049645] clocksource: refined-jiffies: mask: 0xffffffff max_cycles: 0xffffffff, max_idle_ns: 7645519600211568 ns Nov 16 17:42:22 node1 kernel: [ 0.049659] random: get_random_bytes called from start_kernel+0x97/0x516 with crng_init=0 Nov 16 17:42:22 node1 kernel: [ 0.049669] setup_percpu: NR_CPUS:8192 nr_cpumask_bits:1 nr_cpu_ids:1 nr_node_ids:1 Nov 16 17:42:22 node1 kernel: [ 0.050470] percpu: Embedded 46 pages/cpu s151552 r8192 d28672 u2097152 Nov 16 17:42:22 node1 kernel: [ 0.050475] pcpu-alloc: s151552 r8192 d28672 u2097152 alloc=1*2097152 Nov 16 17:42:22 node1 kernel: [ 0.050476] pcpu-alloc: [0] 0 Nov 16 17:42:22 node1 kernel: [ 0.050499] Built 1 zonelists, mobility grouping on. Total pages: 967558 Nov 16 17:42:22 node1 kernel: [ 0.050500] Policy zone: Normal Nov 16 17:42:22 node1 kernel: [ 0.050502] Kernel command line: BOOT_IMAGE=/boot/vmlinuz-5.0.0-1025-gcp root=PARTUUID=a0d4cd9e-2a82-428c-af79-d684141d2d98 ro scsi_mod.use_blk_mq=Y console=ttyS0 Nov 16 17:42:22 node1 kernel: [ 0.072814] Calgary: detecting Calgary via BIOS EBDA area Nov 16 17:42:22 node1 kernel: [ 0.072817] Calgary: Unable to locate Rio Grande table in EBDA - bailing! Nov 16 17:42:22 node1 kernel: [ 0.082612] Memory: 3770872K/3931756K available (14339K kernel code, 2348K rwdata, 4436K rodata, 2588K init, 5180K bss, 160884K reserved, 0K cma-reserved) Nov 16 17:42:22 node1 kernel: [ 0.083441] SLUB: HWalign=64, Order=0-3, MinObjects=0, CPUs=1, Nodes=1 Nov 16 17:42:22 node1 kernel: [ 0.083447] Kernel/User page tables isolation: enabled Nov 16 17:42:22 node1 kernel: [ 0.083463] ftrace: allocating 42092 entries in 165 pages Nov 16 17:42:22 node1 kernel: [ 0.101657] rcu: Hierarchical RCU implementation. Nov 16 17:42:22 node1 kernel: [ 0.101660] rcu: RCU restricting CPUs from NR_CPUS=8192 to nr_cpu_ids=1. Nov 16 17:42:22 node1 kernel: [ 0.101662] Tasks RCU enabled. Nov 16 17:42:22 node1 kernel: [ 0.101663] rcu: RCU calculated value of scheduler-enlistment delay is 25 jiffies. Nov 16 17:42:22 node1 kernel: [ 0.101663] rcu: Adjusting geometry for rcu_fanout_leaf=16, nr_cpu_ids=1 Nov 16 17:42:22 node1 kernel: [ 0.104241] NR_IRQS: 524544, nr_irqs: 256, preallocated irqs: 16 Nov 16 17:42:22 node1 kernel: [ 0.105132] Console: colour VGA+ 80x25 Nov 16 17:42:22 node1 kernel: [ 0.251817] printk: console [ttyS0] enabled Nov 16 17:42:22 node1 kernel: [ 0.252496] ACPI: Core revision 20181213 Nov 16 17:42:22 node1 kernel: [ 0.253906] APIC: Switch to symmetric I/O mode setup Nov 16 17:42:22 node1 kernel: [ 0.255715] x2apic enabled Nov 16 17:42:22 node1 kernel: [ 0.258184] Switched APIC routing to physical x2apic. Nov 16 17:42:22 node1 kernel: [ 0.262902] ..TIMER: vector=0x30 apic1=0 pin1=0 apic2=-1 pin2=-1 Nov 16 17:42:22 node1 kernel: [ 0.264572] clocksource: tsc-early: mask: 0xffffffffffffffff max_cycles: 0x1cd4c1a02bd, max_idle_ns: 440795302132 ns Nov 16 17:42:22 node1 kernel: [ 0.266576] Calibrating delay loop (skipped) preset value.. 4000.31 BogoMIPS (lpj=8000624) Nov 16 17:42:22 node1 kernel: [ 0.268840] pid_max: default: 32768 minimum: 301 Nov 16 17:42:22 node1 kernel: [ 0.270606] LSM: Security Framework initializing Nov 16 17:42:22 node1 kernel: [ 0.271759] Yama: becoming mindful. Nov 16 17:42:22 node1 kernel: [ 0.272415] AppArmor: AppArmor initialized Nov 16 17:42:22 node1 kernel: [ 0.275637] Dentry cache hash table entries: 524288 (order: 10, 4194304 bytes) Nov 16 17:42:22 node1 kernel: [ 0.278357] Inode-cache hash table entries: 262144 (order: 9, 2097152 bytes) Nov 16 17:42:22 node1 kernel: [ 0.278590] Mount-cache hash table entries: 8192 (order: 4, 65536 bytes) Nov 16 17:42:22 node1 kernel: [ 0.279695] Mountpoint-cache hash table entries: 8192 (order: 4, 65536 bytes) Nov 16 17:42:22 node1 kernel: [ 0.282993] Last level iTLB entries: 4KB 64, 2MB 8, 4MB 8 Nov 16 17:42:22 node1 kernel: [ 0.284375] Last level dTLB entries: 4KB 64, 2MB 0, 4MB 0, 1GB 4 Nov 16 17:42:22 node1 kernel: [ 0.286564] Spectre V1 : Mitigation: usercopy/swapgs barriers and __user pointer sanitization Nov 16 17:42:22 node1 kernel: [ 0.288916] Spectre V2 : Mitigation: Full generic retpoline Nov 16 17:42:22 node1 kernel: [ 0.290558] Spectre V2 : Spectre v2 / SpectreRSB mitigation: Filling RSB on context switch Nov 16 17:42:22 node1 kernel: [ 0.292839] Spectre V2 : Enabling Restricted Speculation for firmware calls Nov 16 17:42:22 node1 kernel: [ 0.294573] Spectre V2 : mitigation: Enabling conditional Indirect Branch Prediction Barrier Nov 16 17:42:22 node1 kernel: [ 0.296471] Speculative Store Bypass: Mitigation: Speculative Store Bypass disabled via prctl and seccomp Nov 16 17:42:22 node1 kernel: [ 0.298600] MDS: Mitigation: Clear CPU buffers Nov 16 17:42:22 node1 kernel: [ 0.300119] TAA: Mitigation: Clear CPU buffers Nov 16 17:42:22 node1 kernel: [ 0.318479] Freeing SMP alternatives memory: 36K Nov 16 17:42:22 node1 kernel: [ 0.430291] smpboot: CPU0: Intel(R) Xeon(R) CPU @ 2.00GHz (family: 0x6, model: 0x55, stepping: 0x3) Nov 16 17:42:22 node1 kernel: [ 0.430557] Performance Events: unsupported p6 CPU model 85 no PMU driver, software events only. Nov 16 17:42:22 node1 kernel: [ 0.430557] rcu: Hierarchical SRCU implementation. Nov 16 17:42:22 node1 kernel: [ 0.431562] random: crng done (trusting CPU's manufacturer) Nov 16 17:42:22 node1 kernel: [ 0.433720] NMI watchdog: Perf NMI watchdog permanently disabled Nov 16 17:42:22 node1 kernel: [ 0.434598] smp: Bringing up secondary CPUs ... Nov 16 17:42:22 node1 kernel: [ 0.435249] smp: Brought up 1 node, 1 CPU Nov 16 17:42:22 node1 kernel: [ 0.435987] smpboot: Max logical packages: 1 Nov 16 17:42:22 node1 kernel: [ 0.436626] smpboot: Total of 1 processors activated (4000.31 BogoMIPS) Nov 16 17:42:22 node1 kernel: [ 0.437903] devtmpfs: initialized Nov 16 17:42:22 node1 kernel: [ 0.438472] x86/mm: Memory block size: 128MB Nov 16 17:42:22 node1 kernel: [ 0.439005] clocksource: jiffies: mask: 0xffffffff max_cycles: 0xffffffff, max_idle_ns: 7645041785100000 ns Nov 16 17:42:22 node1 kernel: [ 0.440466] futex hash table entries: 256 (order: 2, 16384 bytes) Nov 16 17:42:22 node1 kernel: [ 0.441464] pinctrl core: initialized pinctrl subsystem Nov 16 17:42:22 node1 kernel: [ 0.442738] RTC time: 22:42:12, date: 2019-11-16 Nov 16 17:42:22 node1 kernel: [ 0.443524] NET: Registered protocol family 16 Nov 16 17:42:22 node1 kernel: [ 0.444228] audit: initializing netlink subsys (disabled) Nov 16 17:42:22 node1 kernel: [ 0.445174] EISA bus registered Nov 16 17:42:22 node1 kernel: [ 0.445691] cpuidle: using governor ladder Nov 16 17:42:22 node1 kernel: [ 0.446279] cpuidle: using governor menu Nov 16 17:42:22 node1 kernel: [ 0.446619] ACPI: bus type PCI registered Nov 16 17:42:22 node1 kernel: [ 0.447249] acpiphp: ACPI Hot Plug PCI Controller Driver version: 0.5 Nov 16 17:42:22 node1 kernel: [ 0.448957] PCI: Using configuration type 1 for base access Nov 16 17:42:22 node1 kernel: [ 0.450590] audit: type=2000 audit(1573944132.357:1): state=initialized audit_enabled=0 res=1 Nov 16 17:42:22 node1 kernel: [ 0.452995] HugeTLB registered 1.00 GiB page size, pre-allocated 0 pages Nov 16 17:42:22 node1 kernel: [ 0.453962] HugeTLB registered 2.00 MiB page size, pre-allocated 0 pages Nov 16 17:42:22 node1 kernel: [ 0.454845] ACPI: Added _OSI(Module Device) Nov 16 17:42:22 node1 kernel: [ 0.455537] ACPI: Added _OSI(Processor Device) Nov 16 17:42:22 node1 kernel: [ 0.456229] ACPI: Added _OSI(3.0 _SCP Extensions) Nov 16 17:42:22 node1 kernel: [ 0.456930] ACPI: Added _OSI(Processor Aggregator Device) Nov 16 17:42:22 node1 kernel: [ 0.458568] ACPI: Added _OSI(Linux-Dell-Video) Nov 16 17:42:22 node1 kernel: [ 0.459245] ACPI: Added _OSI(Linux-Lenovo-NV-HDMI-Audio) Nov 16 17:42:22 node1 kernel: [ 0.460097] ACPI: Added _OSI(Linux-HPI-Hybrid-Graphics) Nov 16 17:42:22 node1 kernel: [ 0.463010] ACPI: 2 ACPI AML tables successfully acquired and loaded Nov 16 17:42:22 node1 kernel: [ 0.465022] ACPI: Interpreter enabled Nov 16 17:42:22 node1 kernel: [ 0.465608] ACPI: (supports S0 S3 S4 S5) Nov 16 17:42:22 node1 kernel: [ 0.466231] ACPI: Using IOAPIC for interrupt routing Nov 16 17:42:22 node1 kernel: [ 0.466577] PCI: Using host bridge windows from ACPI; if necessary, use "pci=nocrs" and report a bug Nov 16 17:42:22 node1 kernel: [ 0.468254] ACPI: Enabled 16 GPEs in block 00 to 0F Nov 16 17:42:22 node1 kernel: [ 0.472255] ACPI: PCI Root Bridge [PCI0] (domain 0000 [bus 00-ff]) Nov 16 17:42:22 node1 kernel: [ 0.473295] acpi PNP0A03:00: _OSC: OS supports [ASPM ClockPM Segments MSI] Nov 16 17:42:22 node1 kernel: [ 0.474323] acpi PNP0A03:00: fail to add MMCONFIG information, can't access extended PCI configuration space under this bridge. Nov 16 17:42:22 node1 kernel: [ 0.475335] PCI host bridge to bus 0000:00 Nov 16 17:42:22 node1 kernel: [ 0.476026] pci_bus 0000:00: root bus resource [io 0x0000-0x0cf7 window] Nov 16 17:42:22 node1 kernel: [ 0.477056] pci_bus 0000:00: root bus resource [io 0x0d00-0xffff window] Nov 16 17:42:22 node1 kernel: [ 0.478560] pci_bus 0000:00: root bus resource [mem 0x000a0000-0x000bffff window] Nov 16 17:42:22 node1 kernel: [ 0.479803] pci_bus 0000:00: root bus resource [mem 0xc0000000-0xfebfffff window] Nov 16 17:42:22 node1 kernel: [ 0.480934] pci_bus 0000:00: root bus resource [bus 00-ff] Nov 16 17:42:22 node1 kernel: [ 0.482604] pci 0000:00:00.0: [8086:1237] type 00 class 0x060000 Nov 16 17:42:22 node1 kernel: [ 0.486106] pci 0000:00:01.0: [8086:7110] type 00 class 0x060100 Nov 16 17:42:22 node1 kernel: [ 0.501543] pci 0000:00:01.3: [8086:7113] type 00 class 0x068000 Nov 16 17:42:22 node1 kernel: [ 0.517807] pci 0000:00:01.3: quirk: [io 0xb000-0xb03f] claimed by PIIX4 ACPI Nov 16 17:42:22 node1 kernel: [ 0.519469] pci 0000:00:03.0: [1af4:1004] type 00 class 0x000000 Nov 16 17:42:22 node1 kernel: [ 0.526567] pci 0000:00:03.0: reg 0x10: [io 0xc000-0xc03f] Nov 16 17:42:22 node1 kernel: [ 0.531858] pci 0000:00:03.0: reg 0x14: [mem 0xfebfe000-0xfebfe07f] Nov 16 17:42:22 node1 kernel: [ 0.547202] pci 0000:00:04.0: [1af4:1000] type 00 class 0x020000 Nov 16 17:42:22 node1 kernel: [ 0.553391] pci 0000:00:04.0: reg 0x10: [io 0xc040-0xc07f] Nov 16 17:42:22 node1 kernel: [ 0.556610] pci 0000:00:04.0: reg 0x14: [mem 0xfebff000-0xfebff03f] Nov 16 17:42:22 node1 kernel: [ 0.578737] ACPI: PCI Interrupt Link [LNKA] (IRQs 5 *10 11) Nov 16 17:42:22 node1 kernel: [ 0.581450] ACPI: PCI Interrupt Link [LNKB] (IRQs 5 *10 11) Nov 16 17:42:22 node1 kernel: [ 0.582654] ACPI: PCI Interrupt Link [LNKC] (IRQs 5 10 *11) Nov 16 17:42:22 node1 kernel: [ 0.584755] ACPI: PCI Interrupt Link [LNKD] (IRQs 5 10 *11) Nov 16 17:42:22 node1 kernel: [ 0.587605] ACPI: PCI Interrupt Link [LNKS] (IRQs *9) Nov 16 17:42:22 node1 kernel: [ 0.588928] SCSI subsystem initialized Nov 16 17:42:22 node1 kernel: [ 0.589556] libata version 3.00 loaded. Nov 16 17:42:22 node1 kernel: [ 0.589596] vgaarb: loaded Nov 16 17:42:22 node1 kernel: [ 0.590005] ACPI: bus type USB registered Nov 16 17:42:22 node1 kernel: [ 0.590574] usbcore: registered new interface driver usbfs Nov 16 17:42:22 node1 kernel: [ 0.591364] usbcore: registered new interface driver hub Nov 16 17:42:22 node1 kernel: [ 0.592114] usbcore: registered new device driver usb Nov 16 17:42:22 node1 kernel: [ 0.592983] pps_core: LinuxPPS API ver. 1 registered Nov 16 17:42:22 node1 kernel: [ 0.593705] pps_core: Software ver. 5.3.6 - Copyright 2005-2007 Rodolfo Giometti Nov 16 17:42:22 node1 kernel: [ 0.594564] PTP clock support registered Nov 16 17:42:22 node1 kernel: [ 0.595418] EDAC MC: Ver: 3.0.0 Nov 16 17:42:22 node1 kernel: [ 0.596102] PCI: Using ACPI for IRQ routing Nov 16 17:42:22 node1 kernel: [ 0.596715] PCI: pci_cache_line_size set to 64 bytes Nov 16 17:42:22 node1 kernel: [ 0.596807] e820: reserve RAM buffer [mem 0x0009fc00-0x0009ffff] Nov 16 17:42:22 node1 kernel: [ 0.596808] e820: reserve RAM buffer [mem 0xbfffd000-0xbfffffff] Nov 16 17:42:22 node1 kernel: [ 0.596922] NetLabel: Initializing Nov 16 17:42:22 node1 kernel: [ 0.597563] NetLabel: domain hash size = 128 Nov 16 17:42:22 node1 kernel: [ 0.598560] NetLabel: protocols = UNLABELED CIPSOv4 CALIPSO Nov 16 17:42:22 node1 kernel: [ 0.599357] NetLabel: unlabeled traffic allowed by default Nov 16 17:42:22 node1 kernel: [ 0.600378] clocksource: Switched to clocksource kvm-clock Nov 16 17:42:22 node1 kernel: [ 0.615756] VFS: Disk quotas dquot_6.6.0 Nov 16 17:42:22 node1 kernel: [ 0.616426] VFS: Dquot-cache hash table entries: 512 (order 0, 4096 bytes) Nov 16 17:42:22 node1 kernel: [ 0.618656] AppArmor: AppArmor Filesystem Enabled Nov 16 17:42:22 node1 kernel: [ 0.619399] pnp: PnP ACPI init Nov 16 17:42:22 node1 kernel: [ 0.620233] pnp 00:00: Plug and Play ACPI device, IDs PNP0b00 (active) Nov 16 17:42:22 node1 kernel: [ 0.620322] pnp 00:01: Plug and Play ACPI device, IDs PNP0303 (active) Nov 16 17:42:22 node1 kernel: [ 0.620375] pnp 00:02: Plug and Play ACPI device, IDs PNP0f13 (active) Nov 16 17:42:22 node1 kernel: [ 0.620436] pnp 00:03: Plug and Play ACPI device, IDs PNP0501 (active) Nov 16 17:42:22 node1 kernel: [ 0.620489] pnp 00:04: Plug and Play ACPI device, IDs PNP0501 (active) Nov 16 17:42:22 node1 kernel: [ 0.620539] pnp 00:05: Plug and Play ACPI device, IDs PNP0501 (active) Nov 16 17:42:22 node1 kernel: [ 0.620588] pnp 00:06: Plug and Play ACPI device, IDs PNP0501 (active) Nov 16 17:42:22 node1 kernel: [ 0.620797] pnp: PnP ACPI: found 7 devices Nov 16 17:42:22 node1 kernel: [ 0.626966] clocksource: acpi_pm: mask: 0xffffff max_cycles: 0xffffff, max_idle_ns: 2085701024 ns Nov 16 17:42:22 node1 kernel: [ 0.628383] pci_bus 0000:00: resource 4 [io 0x0000-0x0cf7 window] Nov 16 17:42:22 node1 kernel: [ 0.628384] pci_bus 0000:00: resource 5 [io 0x0d00-0xffff window] Nov 16 17:42:22 node1 kernel: [ 0.628385] pci_bus 0000:00: resource 6 [mem 0x000a0000-0x000bffff window] Nov 16 17:42:22 node1 kernel: [ 0.628386] pci_bus 0000:00: resource 7 [mem 0xc0000000-0xfebfffff window] Nov 16 17:42:22 node1 kernel: [ 0.628477] NET: Registered protocol family 2 Nov 16 17:42:22 node1 kernel: [ 0.629336] tcp_listen_portaddr_hash hash table entries: 2048 (order: 3, 32768 bytes) Nov 16 17:42:22 node1 kernel: [ 0.630459] TCP established hash table entries: 32768 (order: 6, 262144 bytes) Nov 16 17:42:22 node1 kernel: [ 0.631601] TCP bind hash table entries: 32768 (order: 7, 524288 bytes) Nov 16 17:42:22 node1 kernel: [ 0.632680] TCP: Hash tables configured (established 32768 bind 32768) Nov 16 17:42:22 node1 kernel: [ 0.633826] UDP hash table entries: 2048 (order: 4, 65536 bytes) Nov 16 17:42:22 node1 kernel: [ 0.634708] UDP-Lite hash table entries: 2048 (order: 4, 65536 bytes) Nov 16 17:42:22 node1 kernel: [ 0.635761] NET: Registered protocol family 1 Nov 16 17:42:22 node1 kernel: [ 0.636543] NET: Registered protocol family 44 Nov 16 17:42:22 node1 kernel: [ 0.637294] pci 0000:00:00.0: Limiting direct PCI/PCI transfers Nov 16 17:42:22 node1 kernel: [ 0.638285] PCI: CLS 0 bytes, default 64 Nov 16 17:42:22 node1 kernel: [ 0.638335] PCI-DMA: Using software bounce buffering for IO (SWIOTLB) Nov 16 17:42:22 node1 kernel: [ 0.639236] software IO TLB: mapped [mem 0xbbffd000-0xbfffd000] (64MB) Nov 16 17:42:22 node1 kernel: [ 0.640279] clocksource: tsc: mask: 0xffffffffffffffff max_cycles: 0x1cd4c1a02bd, max_idle_ns: 440795302132 ns Nov 16 17:42:22 node1 kernel: [ 0.641814] check: Scanning for low memory corruption every 60 seconds Nov 16 17:42:22 node1 kernel: [ 0.643501] Initialise system trusted keyrings Nov 16 17:42:22 node1 kernel: [ 0.644222] Key type blacklist registered Nov 16 17:42:22 node1 kernel: [ 0.644879] workingset: timestamp_bits=36 max_order=20 bucket_order=0 Nov 16 17:42:22 node1 kernel: [ 0.648287] zbud: loaded Nov 16 17:42:22 node1 kernel: [ 0.649212] squashfs: version 4.0 (2009/01/31) Phillip Lougher Nov 16 17:42:22 node1 kernel: [ 0.650315] fuse init (API version 7.28) Nov 16 17:42:22 node1 kernel: [ 0.652404] Key type asymmetric registered Nov 16 17:42:22 node1 kernel: [ 0.653069] Asymmetric key parser 'x509' registered Nov 16 17:42:22 node1 kernel: [ 0.653952] Block layer SCSI generic (bsg) driver version 0.4 loaded (major 243) Nov 16 17:42:22 node1 kernel: [ 0.655381] shpchp: Standard Hot Plug PCI Controller Driver version: 0.4 Nov 16 17:42:22 node1 kernel: [ 0.656415] intel_idle: Please enable MWAIT in BIOS SETUP Nov 16 17:42:22 node1 kernel: [ 0.656496] input: Power Button as /devices/LNXSYSTM:00/LNXPWRBN:00/input/input0 Nov 16 17:42:22 node1 kernel: [ 0.657654] ACPI: Power Button [PWRF] Nov 16 17:42:22 node1 kernel: [ 0.658397] input: Sleep Button as /devices/LNXSYSTM:00/LNXSLPBN:00/input/input1 Nov 16 17:42:22 node1 kernel: [ 0.659640] ACPI: Sleep Button [SLPF] Nov 16 17:42:22 node1 kernel: [ 0.662512] PCI Interrupt Link [LNKC] enabled at IRQ 11 Nov 16 17:42:22 node1 kernel: [ 0.663710] virtio-pci 0000:00:03.0: virtio_pci: leaving for legacy driver Nov 16 17:42:22 node1 kernel: [ 0.669019] PCI Interrupt Link [LNKD] enabled at IRQ 10 Nov 16 17:42:22 node1 kernel: [ 0.669905] virtio-pci 0000:00:04.0: virtio_pci: leaving for legacy driver Nov 16 17:42:22 node1 kernel: [ 0.674672] Serial: 8250/16550 driver, 32 ports, IRQ sharing enabled Nov 16 17:42:22 node1 kernel: [ 0.697585] 00:03: ttyS0 at I/O 0x3f8 (irq = 4, base_baud = 115200) is a 16550A Nov 16 17:42:22 node1 kernel: [ 0.721531] 00:04: ttyS1 at I/O 0x2f8 (irq = 3, base_baud = 115200) is a 16550A Nov 16 17:42:22 node1 kernel: [ 0.745450] 00:05: ttyS2 at I/O 0x3e8 (irq = 6, base_baud = 115200) is a 16550A Nov 16 17:42:22 node1 kernel: [ 0.769567] 00:06: ttyS3 at I/O 0x2e8 (irq = 7, base_baud = 115200) is a 16550A Nov 16 17:42:22 node1 kernel: [ 0.772772] Linux agpgart interface v0.103 Nov 16 17:42:22 node1 kernel: [ 0.776430] loop: module loaded Nov 16 17:42:22 node1 kernel: [ 0.789351] scsi host0: Virtio SCSI HBA Nov 16 17:42:22 node1 kernel: [ 0.810260] scsi 0:0:1:0: Direct-Access Google PersistentDisk 1 PQ: 0 ANSI: 6 Nov 16 17:42:22 node1 kernel: [ 0.813067] libphy: Fixed MDIO Bus: probed Nov 16 17:42:22 node1 kernel: [ 0.814305] tun: Universal TUN/TAP device driver, 1.6 Nov 16 17:42:22 node1 kernel: [ 0.815826] PPP generic driver version 2.4.2 Nov 16 17:42:22 node1 kernel: [ 0.817426] ehci_hcd: USB 2.0 'Enhanced' Host Controller (EHCI) Driver Nov 16 17:42:22 node1 kernel: [ 0.819379] ehci-pci: EHCI PCI platform driver Nov 16 17:42:22 node1 kernel: [ 0.820932] ehci-platform: EHCI generic platform driver Nov 16 17:42:22 node1 kernel: [ 0.822523] ohci_hcd: USB 1.1 'Open' Host Controller (OHCI) Driver Nov 16 17:42:22 node1 kernel: [ 0.824464] ohci-pci: OHCI PCI platform driver Nov 16 17:42:22 node1 kernel: [ 0.825893] ohci-platform: OHCI generic platform driver Nov 16 17:42:22 node1 kernel: [ 0.827871] uhci_hcd: USB Universal Host Controller Interface driver Nov 16 17:42:22 node1 kernel: [ 0.829967] i8042: PNP: PS/2 Controller [PNP0303:KBD,PNP0f13:MOU] at 0x60,0x64 irq 1,12 Nov 16 17:42:22 node1 kernel: [ 0.832973] i8042: Warning: Keylock active Nov 16 17:42:22 node1 kernel: [ 0.836112] serio: i8042 KBD port at 0x60,0x64 irq 1 Nov 16 17:42:22 node1 kernel: [ 0.837576] serio: i8042 AUX port at 0x60,0x64 irq 12 Nov 16 17:42:22 node1 kernel: [ 0.839560] mousedev: PS/2 mouse device common for all mice Nov 16 17:42:22 node1 kernel: [ 0.842029] rtc_cmos 00:00: RTC can wake from S4 Nov 16 17:42:22 node1 kernel: [ 0.845528] rtc_cmos 00:00: registered as rtc0 Nov 16 17:42:22 node1 kernel: [ 0.847066] rtc_cmos 00:00: alarms up to one day, 114 bytes nvram Nov 16 17:42:22 node1 kernel: [ 0.848918] i2c /dev entries driver Nov 16 17:42:22 node1 kernel: [ 0.850520] device-mapper: uevent: version 1.0.3 Nov 16 17:42:22 node1 kernel: [ 0.852285] device-mapper: ioctl: 4.39.0-ioctl (2018-04-03) initialised: dm-devel@redhat.com Nov 16 17:42:22 node1 kernel: [ 0.855079] platform eisa.0: Probing EISA bus 0 [ OK ] Started Dispatcher daemon for systemd-networkd. Nov 16 17:42:22 node1 kernel: [ 0.856619] platform eisa.0: EISA: Cannot allocate resource for mainboard Nov 16 17:42:22 node1 kernel: [ 0.858716] platform eisa.0: Cannot allocate resource for EISA slot 1 Nov 16 17:42:22 node1 kernel: [ 0.860466] platform eisa.0: Cannot allocate resource for EISA slot 2 Nov 16 17:42:22 node1 kernel: [ 0.862529] platform eisa.0: Cannot allocate resource for EISA slot 3 Nov 16 17:42:22 node1 kernel: [ 0.864374] platform eisa.0: Cannot allocate resource for EISA slot 4 Nov 16 17:42:22 node1 kernel: [ 0.866172] platform eisa.0: Cannot allocate resource for EISA slot 5 Nov 16 17:42:22 node1 kernel: [ 0.868316] platform eisa.0: Cannot allocate resource for EISA slot 6 Nov 16 17:42:22 node1 kernel: [ 0.870145] platform eisa.0: Cannot allocate resource for EISA slot 7 Nov 16 17:42:22 node1 kernel: [ 0.872081] platform eisa.0: Cannot allocate resource for EISA slot 8 Nov 16 17:42:22 node1 kernel: [ 0.874168] platform eisa.0: EISA: Detected 0 cards Nov 16 17:42:22 node1 kernel: [ 0.875610] ledtrig-cpu: registered to indicate activity on CPUs Nov 16 17:42:22 node1 kernel: [ 0.878381] NET: Registered protocol family 10 Nov 16 17:42:22 node1 kernel: [ 0.881504] Segment Routing with IPv6 Nov 16 17:42:22 node1 kernel: [ 0.882757] NET: Registered protocol family 17 Nov 16 17:42:22 node1 kernel: [ 0.884112] Key type dns_resolver registered Nov 16 17:42:22 node1 kernel: [ 0.885666] mce: Using 32 MCE banks Nov 16 17:42:22 node1 kernel: [ 0.886974] RAS: Correctable Errors collector initialized. Nov 16 17:42:22 node1 kernel: [ 0.888543] sched_clock: Marking stable (736570728, 150153778)->(892020567, -5296061) Nov 16 17:42:22 node1 kernel: [ 0.891905] registered taskstats version 1 Nov 16 17:42:22 node1 kernel: [ 0.893206] Loading compiled-in X.509 certificates Nov 16 17:42:22 node1 kernel: [ 0.895879] Loaded X.509 cert 'Build time autogenerated kernel key: 6aa80556125908d90fc013ceadf27a024df99565' Nov 16 17:42:22 node1 kernel: [ 0.899048] zswap: loaded using pool lzo/zbud Nov 16 17:42:22 node1 kernel: [ 0.900496] sd 0:0:1:0: Attached scsi generic sg0 type 0 Nov 16 17:42:22 node1 kernel: [ 0.902258] sd 0:0:1:0: [sda] 104857600 512-byte logical blocks: (53.7 GB/50.0 GiB) Nov 16 17:42:22 node1 kernel: [ 0.904489] sd 0:0:1:0: [sda] 4096-byte physical blocks Nov 16 17:42:22 node1 kernel: [ 0.906297] sd 0:0:1:0: [sda] Write Protect is off Nov 16 17:42:22 node1 kernel: [ 0.907537] sd 0:0:1:0: [sda] Mode Sense: 1f 00 00 08 Nov 16 17:42:22 node1 kernel: [ 0.907633] sd 0:0:1:0: [sda] Write cache: enabled, read cache: enabled, doesn't support DPO or FUA Nov 16 17:42:22 node1 kernel: [ 0.910619] Key type big_key registered Nov 16 17:42:22 node1 kernel: [ 0.911695] Key type trusted registered Nov 16 17:42:22 node1 kernel: [ 0.912981] Key type encrypted registered Nov 16 17:42:22 node1 kernel: [ 0.914901] AppArmor: AppArmor sha1 policy hashing enabled Nov 16 17:42:22 node1 kernel: [ 0.916453] ima: No TPM chip found, activating TPM-bypass! Nov 16 17:42:22 node1 kernel: [ 0.917960] ima: Allocated hash algorithm: sha1 Nov 16 17:42:22 node1 kernel: [ 0.919390] No architecture policies found Nov 16 17:42:22 node1 kernel: [ 0.920576] evm: Initialising EVM extended attributes: Nov 16 17:42:22 node1 kernel: [ 0.922049] evm: security.selinux Nov 16 17:42:22 node1 kernel: [ 0.922985] evm: security.SMACK64 Nov 16 17:42:22 node1 kernel: [ 0.923944] evm: security.SMACK64EXEC Nov 16 17:42:22 node1 kernel: [ 0.924999] evm: security.SMACK64TRANSMUTE Nov 16 17:42:22 node1 kernel: [ 0.926132] evm: security.SMACK64MMAP Nov 16 17:42:22 node1 kernel: [ 0.927191] evm: security.apparmor Nov 16 17:42:22 node1 kernel: [ 0.928072] evm: security.ima Nov 16 17:42:22 node1 kernel: [ 0.928909] evm: security.capability Nov 16 17:42:22 node1 kernel: [ 0.930004] evm: HMAC attrs: 0x1 Nov 16 17:42:22 node1 kernel: [ 0.931351] Magic number: 11:253:755 Nov 16 17:42:22 node1 kernel: [ 0.932534] tty ttyS6: hash matches Nov 16 17:42:22 node1 kernel: [ 0.933713] rtc_cmos 00:00: setting system clock to 2019-11-16T22:42:13 UTC (1573944133) Nov 16 17:42:22 node1 kernel: [ 0.945150] sda: sda1 sda14 sda15 Nov 16 17:42:22 node1 kernel: [ 0.946549] sd 0:0:1:0: [sda] Attached SCSI disk Nov 16 17:42:22 node1 kernel: [ 1.042942] input: AT Translated Set 2 keyboard as /devices/platform/i8042/serio0/input/input2 Nov 16 17:42:22 node1 kernel: [ 1.044770] md: Waiting for all devices to be available before autodetect Nov 16 17:42:22 node1 kernel: [ 1.046169] md: If you don't use raid, use raid=noautodetect Nov 16 17:42:22 node1 kernel: [ 1.047792] md: Autodetecting RAID arrays. Nov 16 17:42:22 node1 kernel: [ 1.048569] md: autorun ... Nov 16 17:42:22 node1 kernel: [ 1.049190] md: ... autorun DONE. Nov 16 17:42:22 node1 kernel: [ 1.053255] EXT4-fs (sda1): INFO: recovery required on readonly filesystem Nov 16 17:42:22 node1 kernel: [ 1.054409] EXT4-fs (sda1): write access will be enabled during recovery Nov 16 17:42:22 node1 kernel: [ 1.275871] EXT4-fs (sda1): orphan cleanup on readonly fs Nov 16 17:42:22 node1 kernel: [ 1.308237] EXT4-fs (sda1): 46 orphan inodes deleted Nov 16 17:42:22 node1 kernel: [ 1.309040] EXT4-fs (sda1): recovery complete Nov 16 17:42:22 node1 kernel: [ 1.316633] EXT4-fs (sda1): mounted filesystem with ordered data mode. Opts: (null) Nov 16 17:42:22 node1 kernel: [ 1.318084] VFS: Mounted root (ext4 filesystem) readonly on device 8:1. Nov 16 17:42:22 node1 kernel: [ 1.320949] devtmpfs: mounted Nov 16 17:42:22 node1 kernel: [ 1.322816] Freeing unused decrypted memory: 2040K Nov 16 17:42:22 node1 kernel: [ 1.324787] Freeing unused kernel image memory: 2588K Nov 16 17:42:22 node1 kernel: [ 1.330618] Write protecting the kernel read-only data: 22528k Nov 16 17:42:22 node1 kernel: [ 1.332554] Freeing unused kernel image memory: 2016K Nov 16 17:42:22 node1 kernel: [ 1.334209] Freeing unused kernel image memory: 1708K Nov 16 17:42:22 node1 kernel: [ 1.343415] x86/mm: Checked W+X mappings: passed, no W+X pages found. Nov 16 17:42:22 node1 kernel: [ 1.344485] x86/mm: Checking user space page tables Nov 16 17:42:22 node1 kernel: [ 1.353551] x86/mm: Checked W+X mappings: passed, no W+X pages found. Nov 16 17:42:22 node1 kernel: [ 1.354589] Run /sbin/init as init process Nov 16 17:42:22 node1 kernel: [ 1.518109] systemd[1]: Failed to insert module 'autofs4': No such file or directory Nov 16 17:42:22 node1 kernel: [ 1.539984] systemd[1]: systemd 237 running in system mode. (+PAM +AUDIT +SELINUX +IMA +APPARMOR +SMACK +SYSVINIT +UTMP +LIBCRYPTSETUP +GCRYPT +GNUTLS +ACL +XZ +LZ4 +SECCOMP +BLKID +ELFUTILS +KMOD -IDN2 +IDN -PCRE2 default-hierarchy=hybrid) Nov 16 17:42:22 node1 kernel: [ 1.543379] systemd[1]: Detected virtualization kvm. Nov 16 17:42:22 node1 kernel: [ 1.544288] systemd[1]: Detected architecture x86-64. Nov 16 17:42:22 node1 kernel: [ 1.569122] systemd[1]: Set hostname to . Nov 16 17:42:22 node1 kernel: [ 3.376067] systemd[1]: sysinit.target: Found ordering cycle on cloud-init.service/start Nov 16 17:42:22 node1 kernel: [ 3.378793] systemd[1]: sysinit.target: Found dependency on systemd-networkd-wait-online.service/start Nov 16 17:42:22 node1 kernel: [ 3.380992] systemd[1]: sysinit.target: Found dependency on systemd-networkd.service/start Nov 16 17:42:22 node1 kernel: [ 3.383139] systemd[1]: sysinit.target: Found dependency on network-pre.target/start Nov 16 17:42:22 node1 kernel: [ 3.384736] systemd[1]: sysinit.target: Found dependency on firewalld.service/start Nov 16 17:42:22 node1 kernel: [ 3.386467] systemd[1]: sysinit.target: Found dependency on basic.target/start Nov 16 17:42:22 node1 kernel: [ 3.525241] Loading iSCSI transport class v2.0-870. Nov 16 17:42:22 node1 kernel: [ 3.541250] iscsi: registered transport (tcp) Nov 16 17:42:22 node1 kernel: [ 3.575328] iscsi: registered transport (iser) Nov 16 17:42:22 node1 kernel: [ 3.622640] EXT4-fs (sda1): re-mounted. Opts: quota,grpquota,usrquota Nov 16 17:42:22 node1 kernel: [ 3.975070] Adding 4194300k swap on /var/swap. Priority:-2 extents:28 across:14442492k FS Nov 16 17:42:22 node1 kernel: [ 5.505958] cryptd: max_cpu_qlen set to 1000 Nov 16 17:42:22 node1 kernel: [ 5.568627] AVX2 version of gcm_enc/dec engaged. Nov 16 17:42:22 node1 kernel: [ 5.568628] AES CTR mode by8 optimization enabled Nov 16 17:42:22 node1 kernel: [ 5.722715] virtio_net virtio1 ens4: renamed from eth0 Nov 16 17:42:22 node1 kernel: [ 6.307843] input: ImExPS/2 Generic Explorer Mouse as /devices/platform/i8042/serio1/input/input4 Nov 16 17:42:22 node1 kernel: [ 6.488982] FAT-fs (sda15): Volume was not properly unmounted. Some data may be corrupt. Please run fsck. Nov 16 17:42:22 node1 kernel: [ 7.327934] audit: type=1400 audit(1573944139.892:2): apparmor="STATUS" operation="profile_load" profile="unconfined" name="lxc-container-default" pid=438 comm="apparmor_parser" Nov 16 17:42:22 node1 kernel: [ 7.327937] audit: type=1400 audit(1573944139.892:3): apparmor="STATUS" operation="profile_load" profile="unconfined" name="lxc-container-default-cgns" pid=438 comm="apparmor_parser" Nov 16 17:42:22 node1 kernel: [ 7.327938] audit: type=1400 audit(1573944139.892:4): apparmor="STATUS" operation="profile_load" profile="unconfined" name="lxc-container-default-with-mounting" pid=438 comm="apparmor_parser" Nov 16 17:42:22 node1 kernel: [ 7.327941] audit: type=1400 audit(1573944139.892:5): apparmor="STATUS" operation="profile_load" profile="unconfined" name="lxc-container-default-with-nesting" pid=438 comm="apparmor_parser" Nov 16 17:42:22 node1 kernel: [ 7.342658] audit: type=1400 audit(1573944139.908:6): apparmor="STATUS" operation="profile_load" profile="unconfined" name="/sbin/dhclient" pid=441 comm="apparmor_parser" Nov 16 17:42:22 node1 kernel: [ 7.342662] audit: type=1400 audit(1573944139.908:7): apparmor="STATUS" operation="profile_load" profile="unconfined" name="/usr/lib/NetworkManager/nm-dhcp-client.action" pid=441 comm="apparmor_parser" Nov 16 17:42:22 node1 kernel: [ 7.342663] audit: type=1400 audit(1573944139.908:8): apparmor="STATUS" operation="profile_load" profile="unconfined" name="/usr/lib/NetworkManager/nm-dhcp-helper" pid=441 comm="apparmor_parser" Nov 16 17:42:22 node1 kernel: [ 7.342665] audit: type=1400 audit(1573944139.908:9): apparmor="STATUS" operation="profile_load" profile="unconfined" name="/usr/lib/connman/scripts/dhclient-script" pid=441 comm="apparmor_parser" Nov 16 17:42:22 node1 kernel: [ 7.375595] audit: type=1400 audit(1573944139.940:10): apparmor="STATUS" operation="profile_load" profile="unconfined" name="/usr/bin/freshclam" pid=442 comm="apparmor_parser" Nov 16 17:42:22 node1 kernel: [ 7.383390] audit: type=1400 audit(1573944139.948:11): apparmor="STATUS" operation="profile_load" profile="unconfined" name="/usr/bin/lxc-start" pid=443 comm="apparmor_parser" Nov 16 17:42:22 node1 kernel: [ 8.545945] bpfilter: Loaded bpfilter_umh pid 551 Nov 16 17:42:22 node1 kernel: [ 8.756333] new mount options do not match the existing superblock, will be ignored Nov 16 17:42:23 node1 networkd-dispatcher[554]: No valid path found for iwconfig Nov 16 17:42:23 node1 networkd-dispatcher[554]: No valid path found for iw Nov 16 17:42:23 node1 networkd-dispatcher[554]: WARNING: systemd-networkd is not running, output will be incomplete. Nov 16 17:42:23 node1 systemd[1]: Started Dispatcher daemon for systemd-networkd. Nov 16 17:42:24 node1 snapd[553]: AppArmor status: apparmor is enabled and all features are available Nov 16 17:42:25 node1 kernel: [ 12.845764] kauditd_printk_skb: 14 callbacks suppressed Nov 16 17:42:25 node1 kernel: [ 12.845765] audit: type=1400 audit(1573944145.408:26): apparmor="DENIED" operation="open" profile="/usr/bin/freshclam" name="/etc/ssl/openssl.cnf" pid=536 comm="freshclam" requested_mask="r" denied_mask="r" fsuid=0 ouid=0 Nov 16 17:42:25 node1 kernel: [ 12.960388] audit: type=1400 audit(1573944145.524:27): apparmor="DENIED" operation="open" profile="/usr/sbin/clamd" name="/etc/ssl/openssl.cnf" pid=561 comm="clamd" requested_mask="r" denied_mask="r" fsuid=113 ouid=0 [ OK ] Started firewalld - dynamic firewall daemon. [ OK ] Reached target Network (Pre). Starting Network Service... Nov 16 17:42:25 node1 snapd[553]: AppArmor status: apparmor is enabled and all features are available Nov 16 17:42:25 node1 systemd[1]: Started firewalld - dynamic firewall daemon. Nov 16 17:42:25 node1 systemd[1]: Reached target Network (Pre). Nov 16 17:42:25 node1 systemd[1]: Starting Network Service... Nov 16 17:42:25 node1 freshclam[536]: Sat Nov 16 17:42:25 2019 -> ClamAV update process started at Sat Nov 16 17:42:25 2019 [ OK ] Started LXD - container startup/shutdown. Nov 16 17:42:25 node1 systemd[1]: Started LXD - container startup/shutdown. Nov 16 17:42:26 node1 snapd[553]: daemon.go:346: started snapd/2.42.1 (series 16; classic) ubuntu/18.04 (amd64) linux/5.0.0-1025-gcp. Nov 16 17:42:26 node1 freshclam[536]: Sat Nov 16 17:42:26 2019 -> ^Can't query current.cvd.clamav.net Nov 16 17:42:26 node1 freshclam[536]: Sat Nov 16 17:42:26 2019 -> ^Invalid DNS reply. Falling back to HTTP mode. Nov 16 17:42:26 node1 freshclam[536]: Sat Nov 16 17:42:26 2019 -> Reading CVD header (main.cvd): Sat Nov 16 17:42:26 2019 -> ^Can't get information about db.local.clamav.net: Temporary failure in name resolution Nov 16 17:42:26 node1 freshclam[536]: Sat Nov 16 17:42:26 2019 -> ^Can't read main.cvd header from db.local.clamav.net (IP: ) Nov 16 17:42:26 node1 freshclam[536]: Sat Nov 16 17:42:26 2019 -> Trying again in 5 secs... Nov 16 17:42:26 node1 snapd[553]: daemon.go:439: adjusting startup timeout by 40s (pessimistic estimate of 30s plus 5s per snap) Nov 16 17:42:26 node1 systemd-networkd[713]: Enumeration completed [ OK ] Started Network Service. Starting Wait for Network to be Configured... Nov 16 17:42:26 node1 systemd[1]: Started Network Service. Nov 16 17:42:26 node1 systemd[1]: Starting Wait for Network to be Configured... Starting Network Name Resolution... Nov 16 17:42:26 node1 systemd[1]: Starting Network Name Resolution... Nov 16 17:42:26 node1 systemd-networkd[713]: ens4: Interface name change detected, ens4 has been renamed to eth0. Nov 16 17:42:26 node1 systemd-networkd[713]: eth0: Interface name change detected, eth0 has been renamed to ens4. Nov 16 17:42:26 node1 systemd-networkd-wait-online[767]: ignoring: lo [ OK ] Started Wait for Network to be Configured. Nov 16 17:42:26 node1 systemd[1]: Started Wait for Network to be Configured. Nov 16 17:42:26 node1 systemd-resolved[768]: Positive Trust Anchors: Nov 16 17:42:26 node1 systemd-resolved[768]: . IN DS 19036 8 2 49aac11d7b6f6446702e54a1607371607a1a41855200fd2ce1cdde32f24e8fb5 Nov 16 17:42:26 node1 systemd-resolved[768]: . IN DS 20326 8 2 e06d44b80b8f1d39a95c0b0d7c65d08458e880409bbc683457104237c7f8ec8d Nov 16 17:42:26 node1 systemd-resolved[768]: Negative trust anchors: 10.in-addr.arpa 16.172.in-addr.arpa 17.172.in-addr.arpa 18.172.in-addr.arpa 19.172.in-addr.arpa 20.172.in-addr.arpa 21.172.in-addr.arpa 22.172.in-addr.arpa 23.172.in-addr.arpa 24.172.in-addr.arpa 25.172.in-addr.arpa 26.172.in-addr.arpa 27.172.in-addr.arpa 28.172.in-addr.arpa 29.172.in-addr.arpa 30.172.in-addr.arpa 31.172.in-addr.arpa 168.192.in-addr.arpa d.f.ip6.arpa corp home internal intranet lan local private test Nov 16 17:42:26 node1 systemd-resolved[768]: Using system hostname 'node1.is.hostServer.ca'. [ OK ] Started Network Name Resolution. [ OK ] Reached target Network. Nov 16 17:42:26 node1 systemd[1]: Started Network Name Resolution. Nov 16 17:42:26 node1 systemd[1]: Reached target Network. Starting chrony, an NTP client/server... [ OK ] Reached target Network is Online. Starting LSB: web-based account adm…tion interface for Unix systems... Starting LSB: web-based administration interface for Unix systems... Nov 16 17:42:26 node1 systemd[1]: Starting chrony, an NTP client/server... Nov 16 17:42:26 node1 systemd[1]: Reached target Network is Online. Nov 16 17:42:26 node1 systemd[1]: Starting LSB: web-based account administration interface for Unix systems... Nov 16 17:42:26 node1 systemd[1]: Starting LSB: web-based administration interface for Unix systems... Starting Message of the Day... Nov 16 17:42:26 node1 systemd[1]: Starting Message of the Day... [ OK ] Reached target Remote File Systems (Pre). [ OK ] Reached target Remote File Systems. Starting LSB: automatic crash report generation... Nov 16 17:42:26 node1 systemd[1]: Reached target Remote File Systems (Pre). Nov 16 17:42:26 node1 systemd[1]: Reached target Remote File Systems. Nov 16 17:42:26 node1 systemd[1]: Starting LSB: automatic crash report generation... Starting LSB: Start jk_socketd at boot time... Nov 16 17:42:26 node1 systemd[1]: Starting LSB: Start jk_socketd at boot time... Starting LSB: Start/stop the postgrey daemon... Nov 16 17:42:26 node1 systemd[1]: Starting LSB: Start/stop the postgrey daemon... Starting LSB: saslauthd startup script... Starting Availability of block devices... Starting Google Compute Engine Instance Setup... Starting Fail2Ban Service... Nov 16 17:42:26 node1 systemd[1]: Starting LSB: saslauthd startup script... Nov 16 17:42:26 node1 systemd[1]: Starting Availability of block devices... Nov 16 17:42:26 node1 systemd[1]: Starting Google Compute Engine Instance Setup... Nov 16 17:42:26 node1 systemd[1]: Starting Fail2Ban Service... Starting MySQL Community Server... [ OK ] Started Unattended Upgrades Shutdown. Starting The PHP 5.6 FastCGI Process Manager... Starting The PHP 7.2 FastCGI Process Manager... Nov 16 17:42:26 node1 systemd[1]: Starting MySQL Community Server... Nov 16 17:42:26 node1 systemd[1]: Started Unattended Upgrades Shutdown. Nov 16 17:42:26 node1 systemd[1]: Starting The PHP 5.6 FastCGI Process Manager... Nov 16 17:42:26 node1 systemd[1]: Starting The PHP 7.2 FastCGI Process Manager... Starting Permit User Sessions... Starting The PHP 7.3 FastCGI Process Manager... Nov 16 17:42:26 node1 systemd[1]: Starting Permit User Sessions... Nov 16 17:42:26 node1 systemd[1]: Starting The PHP 7.3 FastCGI Process Manager... [ OK ] Started BIND Domain Name Server. [ OK ] Reached target Host and Network Name Lookups. Starting The Apache HTTP Server... Nov 16 17:42:26 node1 systemd[1]: Started BIND Domain Name Server. Nov 16 17:42:26 node1 systemd[1]: Reached target Host and Network Name Lookups. Nov 16 17:42:26 node1 systemd[1]: Starting The Apache HTTP Server... Starting LSB: start and stop Stackdriver Agent... Starting OpenDKIM DomainKeys Identified Mail (DKIM) Milter... Nov 16 17:42:26 node1 systemd[1]: Starting LSB: start and stop Stackdriver Agent... Nov 16 17:42:26 node1 systemd[1]: Starting OpenDKIM DomainKeys Identified Mail (DKIM) Milter... Starting Postfix Mail Transport Agent (instance -)... Nov 16 17:42:26 node1 systemd[1]: Starting Postfix Mail Transport Agent (instance -)... Starting LSB: Script to start/stop the greylist-milter... Nov 16 17:42:26 node1 systemd[1]: Starting LSB: Script to start/stop the greylist-milter... Starting LSB: Starts ProFTPD daemon... [ OK ] Started Fail2Ban Service. Nov 16 17:42:26 node1 systemd[1]: Starting LSB: Starts ProFTPD daemon... Nov 16 17:42:26 node1 systemd[1]: Started Fail2Ban Service. [ OK ] Started Availability of block devices. Nov 16 17:42:26 node1 systemd[1]: Started Availability of block devices. [ OK ] Started Permit User Sessions. [ OK ] Started Getty on tty1. [ OK ] Started Serial Getty on ttyS0. [ OK ] Reached target Login Prompts. Nov 16 17:42:26 node1 systemd[1]: Started Permit User Sessions. Nov 16 17:42:26 node1 systemd[1]: Started Getty on tty1. Nov 16 17:42:26 node1 systemd[1]: Started Serial Getty on ttyS0. Nov 16 17:42:26 node1 systemd[1]: Reached target Login Prompts. Nov 16 17:42:26 node1 apport[810]: * Starting automatic crash report generation: apport Nov 16 17:42:26 node1 postgrey[812]: * Starting postfix greylisting daemon postgrey Nov 16 17:42:26 node1 configure-instance.sh[849]: postconf: warning: /etc/postfix/master.cf: undefined parameter: mua_sender_restrictions Nov 16 17:42:26 node1 configure-instance.sh[849]: postconf: warning: /etc/postfix/master.cf: undefined parameter: mua_client_restrictions Nov 16 17:42:26 node1 configure-instance.sh[849]: postconf: warning: /etc/postfix/master.cf: undefined parameter: mua_helo_restrictions Nov 16 17:42:26 node1 configure-instance.sh[849]: postconf: warning: /etc/postfix/master.cf: undefined parameter: mua_sender_restrictions Nov 16 17:42:26 node1 configure-instance.sh[849]: postconf: warning: /etc/postfix/master.cf: undefined parameter: mua_client_restrictions Nov 16 17:42:26 node1 configure-instance.sh[849]: postconf: warning: /etc/postfix/master.cf: undefined parameter: mua_helo_restrictions Nov 16 17:42:26 node1 milter-greylist[850]: Greylist Mail Filter Daemon: disabled, see /etc/default/milter-greylist [ OK ] Started LSB: Script to start/stop the greylist-milter. Nov 16 17:42:26 node1 systemd[1]: Started LSB: Script to start/stop the greylist-milter. Nov 16 17:42:27 node1 configure-instance.sh[849]: postconf: warning: /etc/postfix/master.cf: undefined parameter: mua_sender_restrictions Nov 16 17:42:27 node1 configure-instance.sh[849]: postconf: warning: /etc/postfix/master.cf: undefined parameter: mua_client_restrictions Nov 16 17:42:27 node1 configure-instance.sh[849]: postconf: warning: /etc/postfix/master.cf: undefined parameter: mua_helo_restrictions Nov 16 17:42:27 node1 configure-instance.sh[849]: postconf: warning: /etc/postfix/master.cf: undefined parameter: mua_sender_restrictions Nov 16 17:42:27 node1 configure-instance.sh[849]: postconf: warning: /etc/postfix/master.cf: undefined parameter: mua_client_restrictions Nov 16 17:42:27 node1 configure-instance.sh[849]: postconf: warning: /etc/postfix/master.cf: undefined parameter: mua_helo_restrictions Nov 16 17:42:27 node1 jk_socketd[823]: version 2.19, no sockets valid specified in configfile /etc/jailkit/jk_socketd.ini or on commandline, nothing to do, exiting... Nov 16 17:42:27 node1 jailkit[811]: Starting jailkit: jk_socketdversion 2.19, no valid sockets specified in configfile /etc/jailkit/jk_socketd.ini or on commandline, nothing to do, exiting... [ OK ] Started LSB: Start jk_socketd at boot time. Nov 16 17:42:27 node1 jailkit[811]: done. Nov 16 17:42:27 node1 systemd[1]: Started LSB: Start jk_socketd at boot time. Nov 16 17:42:27 node1 apport[810]: ...done. [ OK ] Started LSB: automatic crash report generation. Nov 16 17:42:27 node1 systemd[1]: Started LSB: automatic crash report generation. Nov 16 17:42:27 node1 proftpd[851]: * Starting ftp server proftpd Nov 16 17:42:27 node1 saslauthd[815]: * Starting SASL Authentication Daemon saslauthd Nov 16 17:42:27 node1 chronyd[943]: chronyd version 3.2 starting (+CMDMON +NTP +REFCLOCK +RTC +PRIVDROP +SCFILTER +SECHASH +SIGND +ASYNCDNS +IPV6 -DEBUG) Nov 16 17:42:28 node1 chronyd[943]: Frequency -62.615 +/- 0.005 ppm read from /var/lib/chrony/chrony.drift [ OK ] Started Snappy daemon. Starting Wait until snapd is fully seeded... Nov 16 17:42:28 node1 systemd[1]: Started Snappy daemon. Nov 16 17:42:28 node1 systemd[1]: Starting Wait until snapd is fully seeded... [ OK ] Started chrony, an NTP client/server. Nov 16 17:42:28 node1 systemd[1]: Started chrony, an NTP client/server. Nov 16 17:42:29 node1 kernel: [ 16.731598] bridge: filtering via arp/ip/ip6tables is no longer available by default. Update your scripts to load br_netfilter if you need this. Nov 16 17:42:29 node1 configure-instance.sh[849]: postconf: warning: /etc/postfix/master.cf: undefined parameter: mua_sender_restrictions Nov 16 17:42:29 node1 configure-instance.sh[849]: postconf: warning: /etc/postfix/master.cf: undefined parameter: mua_client_restrictions Nov 16 17:42:29 node1 configure-instance.sh[849]: postconf: warning: /etc/postfix/master.cf: undefined parameter: mua_helo_restrictions Nov 16 17:42:29 node1 configure-instance.sh[849]: postconf: warning: /etc/postfix/master.cf: undefined parameter: mua_sender_restrictions Nov 16 17:42:29 node1 configure-instance.sh[849]: postconf: warning: /etc/postfix/master.cf: undefined parameter: mua_client_restrictions Nov 16 17:42:29 node1 configure-instance.sh[849]: postconf: warning: /etc/postfix/master.cf: undefined parameter: mua_helo_restrictions Nov 16 17:42:29 node1 configure-instance.sh[849]: postconf: warning: /etc/postfix/master.cf: undefined parameter: mua_sender_restrictions Nov 16 17:42:29 node1 configure-instance.sh[849]: postconf: warning: /etc/postfix/master.cf: undefined parameter: mua_client_restrictions Nov 16 17:42:29 node1 configure-instance.sh[849]: postconf: warning: /etc/postfix/master.cf: undefined parameter: mua_helo_restrictions Nov 16 17:42:29 node1 configure-instance.sh[849]: postconf: warning: /etc/postfix/master.cf: undefined parameter: mua_sender_restrictions Nov 16 17:42:29 node1 configure-instance.sh[849]: postconf: warning: /etc/postfix/master.cf: undefined parameter: mua_client_restrictions Nov 16 17:42:29 node1 configure-instance.sh[849]: postconf: warning: /etc/postfix/master.cf: undefined parameter: mua_helo_restrictions Nov 16 17:42:29 node1 configure-instance.sh[849]: postconf: warning: /etc/postfix/master.cf: undefined parameter: mua_sender_restrictions Nov 16 17:42:29 node1 configure-instance.sh[849]: postconf: warning: /etc/postfix/master.cf: undefined parameter: mua_client_restrictions Nov 16 17:42:29 node1 configure-instance.sh[849]: postconf: warning: /etc/postfix/master.cf: undefined parameter: mua_helo_restrictions Nov 16 17:42:29 node1 configure-instance.sh[849]: postconf: warning: /etc/postfix/master.cf: undefined parameter: mua_sender_restrictions Nov 16 17:42:29 node1 configure-instance.sh[849]: postconf: warning: /etc/postfix/master.cf: undefined parameter: mua_client_restrictions Nov 16 17:42:29 node1 configure-instance.sh[849]: postconf: warning: /etc/postfix/master.cf: undefined parameter: mua_helo_restrictions Nov 16 17:42:31 node1 stackdriver-agent[847]: mesg: ttyname failed: Inappropriate ioctl for device Nov 16 17:42:31 node1 configure-instance.sh[849]: postconf: warning: /etc/postfix/master.cf: undefined parameter: mua_sender_restrictions Nov 16 17:42:31 node1 configure-instance.sh[849]: postconf: warning: /etc/postfix/master.cf: undefined parameter: mua_client_restrictions Nov 16 17:42:31 node1 configure-instance.sh[849]: postconf: warning: /etc/postfix/master.cf: undefined parameter: mua_helo_restrictions Nov 16 17:42:31 node1 configure-instance.sh[849]: postconf: warning: /etc/postfix/master.cf: undefined parameter: mua_sender_restrictions Nov 16 17:42:31 node1 configure-instance.sh[849]: postconf: warning: /etc/postfix/master.cf: undefined parameter: mua_client_restrictions Nov 16 17:42:31 node1 configure-instance.sh[849]: postconf: warning: /etc/postfix/master.cf: undefined parameter: mua_helo_restrictions Nov 16 17:42:31 node1 freshclam[536]: Sat Nov 16 17:42:31 2019 -> ^Can't query current.cvd.clamav.net Nov 16 17:42:31 node1 freshclam[536]: Sat Nov 16 17:42:31 2019 -> ^Invalid DNS reply. Falling back to HTTP mode. Nov 16 17:42:31 node1 freshclam[536]: Sat Nov 16 17:42:31 2019 -> Reading CVD header (main.cvd): Sat Nov 16 17:42:31 2019 -> ^Can't get information about db.local.clamav.net: Temporary failure in name resolution Nov 16 17:42:31 node1 freshclam[536]: Sat Nov 16 17:42:31 2019 -> ^Can't read main.cvd header from db.local.clamav.net (IP: ) Nov 16 17:42:31 node1 freshclam[536]: Sat Nov 16 17:42:31 2019 -> Trying again in 5 secs... [ OK ] Started OpenDKIM DomainKeys Identified Mail (DKIM) Milter. [ OK ] Started LSB: saslauthd startup script. Nov 16 17:42:31 node1 saslauthd[815]: ...done. Nov 16 17:42:31 node1 systemd[1]: Started OpenDKIM DomainKeys Identified Mail (DKIM) Milter. Nov 16 17:42:31 node1 systemd[1]: Started LSB: saslauthd startup script. Nov 16 17:42:31 node1 named[845]: starting BIND 9.11.3-1ubuntu1.10-Ubuntu (Extended Support Version) Nov 16 17:42:31 node1 named[845]: running on Linux x86_64 5.0.0-1025-gcp #26~18.04.1-Ubuntu SMP Mon Nov 11 13:09:18 UTC 2019 Nov 16 17:42:31 node1 named[845]: built with '--build=x86_64-linux-gnu' '--prefix=/usr' '--includedir=/usr/include' '--mandir=/usr/sNov 16 17:42:31 node1 systemd[1]: Started Message of the Day. Nov 16 17:42:32 node1 stackdriver-agent[847]: option = Interval; value = 60.000000; Nov 16 17:42:32 node1 stackdriver-agent[847]: option = Hostname; value = ; Nov 16 17:42:32 node1 stackdriver-agent[847]: option = FQDNLookup; value = false; Nov 16 17:42:32 node1 stackdriver-agent[847]: Created new plugin context. Nov 16 17:42:32 node1 named[845]: loading configuration from '/etc/bind/named.conf' Ubuntu 18.04.3 LTS node1.is.hostServer.ca ttyS0 node1 login: Nov 16 17:42:33 node1 collectd[1184]: plugin_load: plugin "syslog" successfully loaded. Nov 16 17:42:33 node1 collectd[1184]: type = syslog, key = LogLevel, value = info Nov 16 17:42:33 node1 collectd[1184]: plugin_load: plugin "df" successfully loaded. Nov 16 17:42:33 node1 named[845]: reading built-in trust anchors from file '/etc/bind/bind.keys' Nov 16 17:42:33 node1 collectd[1184]: plugin_load: plugin "cpu" successfully loaded. Nov 16 17:42:33 node1 collectd[1184]: plugin_load: plugin "swap" successfully loaded. Nov 16 17:42:33 node1 systemd[1]: Started Wait until snapd is fully seeded. Nov 16 17:42:33 node1 systemd[1]: Starting Apply the settings specified in cloud-config... Nov 16 17:42:33 node1 collectd[1184]: plugin_load: plugin "interface" successfully loaded. Nov 16 17:42:33 node1 named[845]: initializing GeoIP Country (IPv4) (type 1) DB Nov 16 17:42:33 node1 collectd[1184]: plugin_load: plugin "disk" successfully loaded. Nov 16 17:42:33 node1 named[845]: GEO-106FREE 20180315 Build Nov 16 17:42:33 node1 named[845]: initializing GeoIP Country (IPv6) (type 12) DB Nov 16 17:42:33 node1 collectd[1184]: plugin_load: plugin "load" successfully loaded. Nov 16 17:42:34 node1 named[845]: GEO-106FREE 20180315 Build Nov 16 17:42:34 node1 named[845]: GeoIP City (IPv4) (type 2) DB not available Nov 16 17:42:34 node1 named[845]: GeoIP City (IPv4) (type 6) DB not available Nov 16 17:42:34 node1 named[845]: GeoIP City (IPv6) (type 30) DB not available Nov 16 17:42:34 node1 named[845]: GeoIP City (IPv6) (type 31) DB not available Nov 16 17:42:34 node1 named[845]: GeoIP Region (type 3) DB not available Nov 16 17:42:34 node1 named[845]: GeoIP Region (type 7) DB not available Nov 16 17:42:34 node1 named[845]: GeoIP ISP (type 4) DB not available Nov 16 17:42:34 node1 named[845]: GeoIP Org (type 5) DB not available Nov 16 17:42:34 node1 named[845]: GeoIP AS (type 9) DB not available Nov 16 17:42:34 node1 named[845]: GeoIP Domain (type 11) DB not available Nov 16 17:42:34 node1 named[845]: GeoIP NetSpeed (type 10) DB not available Nov 16 17:42:34 node1 collectd[1184]: plugin_load: plugin "memory" successfully loaded. Nov 16 17:42:34 node1 named[845]: using default UDP/IPv4 port range: [32768, 60999] Nov 16 17:42:34 node1 named[845]: using default UDP/IPv6 port range: [32768, 60999] Nov 16 17:42:34 node1 named[845]: listening on IPv6 interfaces, port 53 Nov 16 17:42:34 node1 named[845]: listening on IPv4 interface lo, 127.0.0.1#53 Nov 16 17:42:34 node1 named[845]: generating session key for dynamic DNS Nov 16 17:42:34 node1 named[845]: sizing zone task pool based on 13 zones Nov 16 17:42:34 node1 collectd[1184]: plugin_load: plugin "processes" successfully loaded. Nov 16 17:42:34 node1 named[845]: none:103: 'max-cache-size 90%' - setting to 3321MB (out of 3690MB) Nov 16 17:42:34 node1 collectd[1184]: plugin_load: plugin "tcpconns" successfully loaded. Nov 16 17:42:34 node1 named[845]: obtaining root key for view _default from '/etc/bind/bind.keys' Nov 16 17:42:34 node1 named[845]: set up managed keys zone for view _default, file 'managed-keys.bind' Nov 16 17:42:34 node1 named[845]: automatic empty zone: 10.IN-ADDR.ARPA Nov 16 17:42:34 node1 named[845]: automatic empty zone: 16.172.IN-ADDR.ARPA Nov 16 17:42:34 node1 named[845]: automatic empty zone: 17.172.IN-ADDR.ARPA Nov 16 17:42:34 node1 named[845]: automatic empty zone: 18.172.IN-ADDR.ARPA Nov 16 17:42:34 node1 named[845]: automatic empty zone: 19.172.IN-ADDR.ARPA Nov 16 17:42:34 node1 named[845]: automatic empty zone: 20.172.IN-ADDR.ARPA Nov 16 17:42:34 node1 named[845]: automatic empty zone: 21.172.IN-ADDR.ARPA Nov 16 17:42:34 node1 named[845]: automatic empty zone: 22.172.IN-ADDR.ARPA Nov 16 17:42:34 node1 named[845]: automatic empty zone: 23.172.IN-ADDR.ARPA Nov 16 17:42:34 node1 named[845]: automatic empty zone: 24.172.IN-ADDR.ARPA Nov 16 17:42:34 node1 named[845]: automatic empty zone: 25.172.IN-ADDR.ARPA Nov 16 17:42:34 node1 named[845]: automatic empty zone: 26.172.IN-ADDR.ARPA Nov 16 17:42:34 node1 named[845]: automatic empty zone: 27.172.IN-ADDR.ARPA Nov 16 17:42:34 node1 named[845]: automatic empty zone: 28.172.IN-ADDR.ARPA Nov 16 17:42:34 node1 named[845]: automatic empty zone: 29.172.IN-ADDR.ARPA Nov 16 17:42:34 node1 named[845]: automatic empty zone: 30.172.IN-ADDR.ARPA Nov 16 17:42:34 node1 named[845]: automatic empty zone: 31.172.IN-ADDR.ARPA Nov 16 17:42:34 node1 named[845]: automatic empty zone: 168.192.IN-ADDR.ARPA Nov 16 17:42:34 node1 named[845]: automatic empty zone: 64.100.IN-ADDR.ARPA Nov 16 17:42:34 node1 named[845]: automatic empty zone: 65.100.IN-ADDR.ARPA Nov 16 17:42:34 node1 named[845]: automatic empty zone: 66.100.IN-ADDR.ARPA Nov 16 17:42:34 node1 named[845]: automatic empty zone: 67.100.IN-ADDR.ARPA Nov 16 17:42:34 node1 named[845]: automatic empty zone: 68.100.IN-ADDR.ARPA Nov 16 17:42:34 node1 named[845]: automatic empty zone: 69.100.IN-ADDR.ARPA Nov 16 17:42:34 node1 named[845]: automatic empty zone: 70.100.IN-ADDR.ARPA Nov 16 17:42:34 node1 named[845]: automatic empty zone: 71.100.IN-ADDR.ARPA Nov 16 17:42:34 node1 named[845]: automatic empty zone: 72.100.IN-ADDR.ARPA Nov 16 17:42:34 node1 named[845]: automatic empty zone: 73.100.IN-ADDR.ARPA Nov 16 17:42:34 node1 named[845]: automatic empty zone: 74.100.IN-ADDR.ARPA Nov 16 17:42:34 node1 named[845]: automatic empty zone: 75.100.IN-ADDR.ARPA Nov 16 17:42:34 node1 named[845]: automatic empty zone: 76.100.IN-ADDR.ARPA Nov 16 17:42:34 node1 named[845]: automatic empty zone: 77.100.IN-ADDR.ARPA Nov 16 17:42:34 node1 named[845]: automatic empty zone: 78.100.IN-ADDR.ARPA Nov 16 17:42:34 node1 named[845]: automatic empty zone: 79.100.IN-ADDR.ARPA Nov 16 17:42:34 node1 named[845]: automatic empty zone: 80.100.IN-ADDR.ARPA Nov 16 17:42:34 node1 named[845]: automatic empty zone: 81.100.IN-ADDR.ARPA Nov 16 17:42:34 node1 named[845]: automatic empty zone: 82.100.IN-ADDR.ARPA Nov 16 17:42:34 node1 named[845]: automatic empty zone: 83.100.IN-ADDR.ARPA Nov 16 17:42:34 node1 named[845]: automatic empty zone: 84.100.IN-ADDR.ARPA Nov 16 17:42:34 node1 named[845]: automatic empty zone: 85.100.IN-ADDR.ARPA Nov 16 17:42:34 node1 named[845]: automatic empty zone: 86.100.IN-ADDR.ARPA Nov 16 17:42:34 node1 named[845]: automatic empty zone: 87.100.IN-ADDR.ARPA Nov 16 17:42:34 node1 named[845]: automatic empty zone: 88.100.IN-ADDR.ARPA Nov 16 17:42:34 node1 named[845]: automatic empty zone: 89.100.IN-ADDR.ARPA Nov 16 17:42:34 node1 named[845]: automatic empty zone: 90.100.IN-ADDR.ARPA Nov 16 17:42:34 node1 named[845]: automatic empty zone: 91.100.IN-ADDR.ARPA Nov 16 17:42:34 node1 named[845]: automatic empty zone: 92.100.IN-ADDR.ARPA Nov 16 17:42:34 node1 named[845]: automatic empty zone: 93.100.IN-ADDR.ARPA Nov 16 17:42:34 node1 named[845]: automatic empty zone: 94.100.IN-ADDR.ARPA Nov 16 17:42:34 node1 named[845]: automatic empty zone: 95.100.IN-ADDR.ARPA Nov 16 17:42:34 node1 named[845]: automatic empty zone: 96.100.IN-ADDR.ARPA Nov 16 17:42:34 node1 named[845]: automatic empty zone: 97.100.IN-ADDR.ARPA Nov 16 17:42:34 node1 named[845]: automatic empty zone: 98.100.IN-ADDR.ARPA Nov 16 17:42:34 node1 named[845]: automatic empty zone: 99.100.IN-ADDR.ARPA Nov 16 17:42:34 node1 named[845]: automatic empty zone: 100.100.IN-ADDR.ARPA Nov 16 17:42:34 node1 named[845]: automatic empty zone: 101.100.IN-ADDR.ARPA Nov 16 17:42:34 node1 named[845]: automatic empty zone: 102.100.IN-ADDR.ARPA Nov 16 17:42:34 node1 named[845]: automatic empty zone: 103.100.IN-ADDR.ARPA Nov 16 17:42:34 node1 named[845]: automatic empty zone: 104.100.IN-ADDR.ARPA Nov 16 17:42:34 node1 named[845]: automatic empty zone: 105.100.IN-ADDR.ARPA Nov 16 17:42:34 node1 named[845]: automatic empty zone: 106.100.IN-ADDR.ARPA Nov 16 17:42:34 node1 named[845]: automatic empty zone: 107.100.IN-ADDR.ARPA Nov 16 17:42:34 node1 named[845]: automatic empty zone: 108.100.IN-ADDR.ARPA Nov 16 17:42:34 node1 named[845]: automatic empty zone: 109.100.IN-ADDR.ARPA Nov 16 17:42:34 node1 named[845]: automatic empty zone: 110.100.IN-ADDR.ARPA Nov 16 17:42:34 node1 named[845]: automatic empty zone: 111.100.IN-ADDR.ARPA Nov 16 17:42:34 node1 named[845]: automatic empty zone: 112.100.IN-ADDR.ARPA Nov 16 17:42:34 node1 named[845]: automatic empty zone: 113.100.IN-ADDR.ARPA Nov 16 17:42:34 node1 named[845]: automatic empty zone: 114.100.IN-ADDR.ARPA Nov 16 17:42:34 node1 named[845]: automatic empty zone: 115.100.IN-ADDR.ARPA Nov 16 17:42:34 node1 named[845]: automatic empty zone: 116.100.IN-ADDR.ARPA Nov 16 17:42:34 node1 named[845]: automatic empty zone: 117.100.IN-ADDR.ARPA Nov 16 17:42:34 node1 named[845]: automatic empty zone: 118.100.IN-ADDR.ARPA Nov 16 17:42:34 node1 named[845]: automatic empty zone: 119.100.IN-ADDR.ARPA Nov 16 17:42:34 node1 named[845]: automatic empty zone: 120.100.IN-ADDR.ARPA Nov 16 17:42:34 node1 named[845]: automatic empty zone: 121.100.IN-ADDR.ARPA Nov 16 17:42:34 node1 named[845]: automatic empty zone: 122.100.IN-ADDR.ARPA Nov 16 17:42:34 node1 named[845]: automatic empty zone: 123.100.IN-ADDR.ARPA Nov 16 17:42:34 node1 named[845]: automatic empty zone: 124.100.IN-ADDR.ARPA Nov 16 17:42:34 node1 named[845]: automatic empty zone: 125.100.IN-ADDR.ARPA Nov 16 17:42:34 node1 named[845]: automatic empty zone: 126.100.IN-ADDR.ARPA Nov 16 17:42:34 node1 named[845]: automatic empty zone: 127.100.IN-ADDR.ARPA Nov 16 17:42:34 node1 named[845]: automatic empty zone: 254.169.IN-ADDR.ARPA Nov 16 17:42:34 node1 named[845]: automatic empty zone: 2.0.192.IN-ADDR.ARPA Nov 16 17:42:34 node1 named[845]: automatic empty zone: 100.51.198.IN-ADDR.ARPA Nov 16 17:42:34 node1 named[845]: automatic empty zone: 113.0.203.IN-ADDR.ARPA Nov 16 17:42:34 node1 named[845]: automatic empty zone: 255.255.255.255.IN-ADDR.ARPA Nov 16 17:42:34 node1 named[845]: automatic empty zone: 0.0.0.0.0.0.0.0.0.0.0.0.0.0.0.0.0.0.0.0.0.0.0.0.0.0.0.0.0.0.0.0.IP6.ARPA Nov 16 17:42:34 node1 named[845]: automatic empty zone: 1.0.0.0.0.0.0.0.0.0.0.0.0.0.0.0.0.0.0.0.0.0.0.0.0.0.0.0.0.0.0.0.IP6.ARPA Nov 16 17:42:34 node1 named[845]: automatic empty zone: D.F.IP6.ARPA Nov 16 17:42:34 node1 named[845]: automatic empty zone: 8.E.F.IP6.ARPA Nov 16 17:42:34 node1 named[845]: automatic empty zone: 9.E.F.IP6.ARPA Nov 16 17:42:34 node1 named[845]: automatic empty zone: A.E.F.IP6.ARPA Nov 16 17:42:34 node1 named[845]: automatic empty zone: B.E.F.IP6.ARPA Nov 16 17:42:34 node1 named[845]: automatic empty zone: 8.B.D.0.1.0.0.2.IP6.ARPA Nov 16 17:42:34 node1 named[845]: automatic empty zone: EMPTY.AS112.ARPA Nov 16 17:42:34 node1 named[845]: none:103: 'max-cache-size 90%' - setting to 3321MB (out of 3690MB) Nov 16 17:42:34 node1 named[845]: configuring command channel from '/etc/bind/rndc.key' Nov 16 17:42:34 node1 postmulti[1282]: /usr/sbin/postconf: warning: /etc/postfix/master.cf: undefined parameter: mua_sender_restrictions Nov 16 17:42:34 node1 postmulti[1282]: /usr/sbin/postconf: warning: /etc/postfix/master.cf: undefined parameter: mua_client_restrictions Nov 16 17:42:34 node1 postmulti[1282]: /usr/sbin/postconf: warning: /etc/postfix/master.cf: undefined parameter: mua_helo_restrictions Nov 16 17:42:34 node1 postmulti[1282]: /usr/sbin/postconf: warning: /etc/postfix/master.cf: undefined parameter: mua_sender_restrictions Nov 16 17:42:34 node1 postmulti[1282]: /usr/sbin/postconf: warning: /etc/postfix/master.cf: undefined parameter: mua_client_restrictions Nov 16 17:42:34 node1 postmulti[1282]: /usr/sbin/postconf: warning: /etc/postfix/master.cf: undefined parameter: mua_helo_restrictions Nov 16 17:42:34 node1 fail2ban-server[852]: Found no accessible config files for 'filter.d/sshd-ddos' under /etc/fail2ban Nov 16 17:42:34 node1 fail2ban-server[852]: Unable to read the filter 'sshd-ddos' Nov 16 17:42:34 node1 fail2ban-server[852]: Errors in jail 'ssh-ddos'. Skipping... Nov 16 17:42:34 node1 named[845]: command channel listening on 127.0.0.1#953 Nov 16 17:42:34 node1 named[845]: configuring command channel from '/etc/bind/rndc.key' Nov 16 17:42:34 node1 named[845]: command channel listening on ::1#953 Nov 16 17:42:34 node1 collectd[1184]: write_gcm: inside module_register for stackdriver_agent/5.5.2-1000.bionic Nov 16 17:42:34 node1 collectd[1184]: plugin_load: plugin "write_gcm" successfully loaded. Nov 16 17:42:34 node1 named[845]: managed-keys-zone: journal file is out of date: removing journal file Nov 16 17:42:34 node1 named[845]: managed-keys-zone: loaded serial 42 Nov 16 17:42:34 node1 postmulti[1282]: /usr/sbin/postconf: warning: /etc/postfix/master.cf: undefined parameter: mua_sender_restrictions Nov 16 17:42:34 node1 postmulti[1282]: /usr/sbin/postconf: warning: /etc/postfix/master.cf: undefined parameter: mua_client_restrictions Nov 16 17:42:34 node1 postmulti[1282]: /usr/sbin/postconf: warning: /etc/postfix/master.cf: undefined parameter: mua_helo_restrictions Nov 16 17:42:34 node1 postmulti[1282]: /usr/sbin/postconf: warning: /etc/postfix/master.cf: undefined parameter: mua_sender_restrictions Nov 16 17:42:34 node1 postmulti[1282]: /usr/sbin/postconf: warning: /etc/postfix/master.cf: undefined parameter: mua_client_restrictions Nov 16 17:42:34 node1 postmulti[1282]: /usr/sbin/postconf: warning: /etc/postfix/master.cf: undefined parameter: mua_helo_restrictions Nov 16 17:42:34 node1 collectd[1184]: plugin_load: plugin "match_regex" successfully loaded. Nov 16 17:42:34 node1 postmulti[1282]: /usr/sbin/postconf: warning: /etc/postfix/master.cf: undefined parameter: mua_sender_restrictions Nov 16 17:42:34 node1 named[845]: zone 0.in-addr.arpa/IN: loaded serial 1 Nov 16 17:42:34 node1 postmulti[1282]: /usr/sbin/postconf: warning: /etc/postfix/master.cf: undefined parameter: mua_client_restrictions Nov 16 17:42:34 node1 postmulti[1282]: /usr/sbin/postconf: warning: /etc/postfix/master.cf: undefined parameter: mua_helo_restrictions Nov 16 17:42:34 node1 postmulti[1282]: /usr/sbin/postconf: warning: /etc/postfix/master.cf: undefined parameter: mua_sender_restrictions Nov 16 17:42:34 node1 postmulti[1282]: /usr/sbin/postconf: warning: /etc/postfix/master.cf: undefined parameter: mua_client_restrictions Nov 16 17:42:34 node1 postmulti[1282]: /usr/sbin/postconf: warning: /etc/postfix/master.cf: undefined parameter: mua_helo_restrictions Nov 16 17:42:34 node1 collectd[1184]: plugin_load: plugin "match_throttle_metadata_keys" successfully loaded. Nov 16 17:42:34 node1 named[845]: zone 127.in-addr.arpa/IN: loaded serial 1 Nov 16 17:42:34 node1 collectd[1184]: plugin_load: plugin "stackdriver_agent" successfully loaded. Nov 16 17:42:35 node1 postmulti[1282]: /usr/sbin/postconf: warning: /etc/postfix/master.cf: undefined parameter: mua_sender_restrictions Nov 16 17:42:35 node1 postmulti[1282]: /usr/sbin/postconf: warning: /etc/postfix/master.cf: undefined parameter: mua_client_restrictions Nov 16 17:42:35 node1 postmulti[1282]: /usr/sbin/postconf: warning: /etc/postfix/master.cf: undefined parameter: mua_helo_restrictions Nov 16 17:42:35 node1 postmulti[1282]: /usr/sbin/postconf: warning: /etc/postfix/master.cf: undefined parameter: mua_sender_restrictions Nov 16 17:42:35 node1 postmulti[1282]: /usr/sbin/postconf: warning: /etc/postfix/master.cf: undefined parameter: mua_client_restrictions Nov 16 17:42:35 node1 postmulti[1282]: /usr/sbin/postconf: warning: /etc/postfix/master.cf: undefined parameter: mua_helo_restrictions Nov 16 17:42:35 node1 postmulti[1282]: /usr/sbin/postconf: warning: /etc/postfix/master.cf: undefined parameter: mua_sender_restrictions Nov 16 17:42:35 node1 postmulti[1282]: /usr/sbin/postconf: warning: /etc/postfix/master.cf: undefined parameter: mua_client_restrictions Nov 16 17:42:35 node1 postmulti[1282]: /usr/sbin/postconf: warning: /etc/postfix/master.cf: undefined parameter: mua_helo_restrictions Nov 16 17:42:35 node1 postmulti[1282]: /usr/sbin/postconf: warning: /etc/postfix/master.cf: undefined parameter: mua_sender_restrictions Nov 16 17:42:35 node1 postmulti[1282]: /usr/sbin/postconf: warning: /etc/postfix/master.cf: undefined parameter: mua_client_restrictions Nov 16 17:42:35 node1 postmulti[1282]: /usr/sbin/postconf: warning: /etc/postfix/master.cf: undefined parameter: mua_helo_restrictions Nov 16 17:42:35 node1 postmulti[1282]: /usr/sbin/postconf: warning: /etc/postfix/master.cf: undefined parameter: mua_sender_restrictions Nov 16 17:42:35 node1 postmulti[1282]: /usr/sbin/postconf: warning: /etc/postfix/master.cf: undefined parameter: mua_client_restrictions Nov 16 17:42:35 node1 postmulti[1282]: /usr/sbin/postconf: warning: /etc/postfix/master.cf: undefined parameter: mua_helo_restrictions Nov 16 17:42:35 node1 postmulti[1282]: /usr/sbin/postconf: warning: /etc/postfix/master.cf: undefined parameter: mua_sender_restrictions Nov 16 17:42:35 node1 postmulti[1282]: /usr/sbin/postconf: warning: /etc/postfix/master.cf: undefined parameter: mua_client_restrictions Nov 16 17:42:35 node1 postmulti[1282]: /usr/sbin/postconf: warning: /etc/postfix/master.cf: undefined parameter: mua_helo_restrictions Nov 16 17:42:35 node1 postmulti[1282]: /usr/sbin/postconf: warning: /etc/postfix/master.cf: undefined parameter: mua_sender_restrictions Nov 16 17:42:35 node1 postmulti[1282]: /usr/sbin/postconf: warning: /etc/postfix/master.cf: undefined parameter: mua_client_restrictions Nov 16 17:42:35 node1 postmulti[1282]: /usr/sbin/postconf: warning: /etc/postfix/master.cf: undefined parameter: mua_helo_restrictions Nov 16 17:42:35 node1 postmulti[1282]: /usr/sbin/postconf: warning: /etc/postfix/master.cf: undefined parameter: mua_sender_restrictions Nov 16 17:42:35 node1 postmulti[1282]: /usr/sbin/postconf: warning: /etc/postfix/master.cf: undefined parameter: mua_client_restrictions Nov 16 17:42:35 node1 postmulti[1282]: /usr/sbin/postconf: warning: /etc/postfix/master.cf: undefined parameter: mua_helo_restrictions Nov 16 17:42:35 node1 postmulti[1282]: /usr/sbin/postconf: warning: /etc/postfix/master.cf: undefined parameter: mua_sender_restrictions Nov 16 17:42:35 node1 postmulti[1282]: /usr/sbin/postconf: warning: /etc/postfix/master.cf: undefined parameter: mua_client_restrictions Nov 16 17:42:35 node1 postmulti[1282]: /usr/sbin/postconf: warning: /etc/postfix/master.cf: undefined parameter: mua_helo_restrictions Nov 16 17:42:35 node1 postmulti[1282]: /usr/sbin/postconf: warning: /etc/postfix/master.cf: undefined parameter: mua_sender_restrictions Nov 16 17:42:35 node1 postmulti[1282]: /usr/sbin/postconf: warning: /etc/postfix/master.cf: undefined parameter: mua_client_restrictions Nov 16 17:42:35 node1 postmulti[1282]: /usr/sbin/postconf: warning: /etc/postfix/master.cf: undefined parameter: mua_helo_restrictions Nov 16 17:42:35 node1 postmulti[1282]: /usr/sbin/postconf: warning: /etc/postfix/master.cf: undefined parameter: mua_sender_restrictions Nov 16 17:42:35 node1 collectd[1184]: plugin_load: plugin "exec" successfully loaded. Nov 16 17:42:35 node1 postmulti[1282]: /usr/sbin/postconf: warning: /etc/postfix/master.cf: undefined parameter: mua_client_restrictions Nov 16 17:42:35 node1 postmulti[1282]: /usr/sbin/postconf: warning: /etc/postfix/master.cf: undefined parameter: mua_helo_restrictions Nov 16 17:42:35 node1 postmulti[1282]: /usr/sbin/postconf: warning: /etc/postfix/master.cf: undefined parameter: mua_sender_restrictions Nov 16 17:42:35 node1 postmulti[1282]: /usr/sbin/postconf: warning: /etc/postfix/master.cf: undefined parameter: mua_client_restrictions Nov 16 17:42:35 node1 postmulti[1282]: /usr/sbin/postconf: warning: /etc/postfix/master.cf: undefined parameter: mua_helo_restrictions Nov 16 17:42:35 node1 postmulti[1282]: /usr/sbin/postconf: warning: /etc/postfix/master.cf: undefined parameter: mua_sender_restrictions Nov 16 17:42:35 node1 postmulti[1282]: /usr/sbin/postconf: warning: /etc/postfix/master.cf: undefined parameter: mua_client_restrictions Nov 16 17:42:35 node1 postmulti[1282]: /usr/sbin/postconf: warning: /etc/postfix/master.cf: undefined parameter: mua_helo_restrictions Nov 16 17:42:35 node1 postmulti[1282]: /usr/sbin/postconf: warning: /etc/postfix/master.cf: undefined parameter: mua_sender_restrictions Nov 16 17:42:35 node1 postmulti[1282]: /usr/sbin/postconf: warning: /etc/postfix/master.cf: undefined parameter: mua_client_restrictions Nov 16 17:42:35 node1 postmulti[1282]: /usr/sbin/postconf: warning: /etc/postfix/master.cf: undefined parameter: mua_helo_restrictions Nov 16 17:42:35 node1 postmulti[1282]: /usr/sbin/postconf: warning: /etc/postfix/master.cf: undefined parameter: mua_sender_restrictions Nov 16 17:42:35 node1 postmulti[1282]: /usr/sbin/postconf: warning: /etc/postfix/master.cf: undefined parameter: mua_client_restrictions Nov 16 17:42:35 node1 postmulti[1282]: /usr/sbin/postconf: warning: /etc/postfix/master.cf: undefined parameter: mua_helo_restrictions Nov 16 17:42:35 node1 postmulti[1282]: /usr/sbin/postconf: warning: /etc/postfix/master.cf: undefined parameter: mua_sender_restrictions Nov 16 17:42:35 node1 postmulti[1282]: /usr/sbin/postconf: warning: /etc/postfix/master.cf: undefined parameter: mua_client_restrictions Nov 16 17:42:35 node1 postmulti[1282]: /usr/sbin/postconf: warning: /etc/postfix/master.cf: undefined parameter: mua_helo_restrictions Nov 16 17:42:35 node1 named[845]: zone hostedUser.com/IN: loaded serial 1572390285 Nov 16 17:42:35 node1 postmulti[1282]: /usr/sbin/postconf: warning: /etc/postfix/master.cf: undefined parameter: mua_sender_restrictions Nov 16 17:42:35 node1 postmulti[1282]: /usr/sbin/postconf: warning: /etc/postfix/master.cf: undefined parameter: mua_client_restrictions Nov 16 17:42:35 node1 postmulti[1282]: /usr/sbin/postconf: warning: /etc/postfix/master.cf: undefined parameter: mua_helo_restrictions Nov 16 17:42:35 node1 postmulti[1282]: /usr/sbin/postconf: warning: /etc/postfix/master.cf: undefined parameter: mua_sender_restrictions Nov 16 17:42:35 node1 postmulti[1282]: /usr/sbin/postconf: warning: /etc/postfix/master.cf: undefined parame[ 22.700905] cloud-init[1271]: failed run of stage modules-config [ 23.119257] cloud-init[1271]: ------------------------------------------------------------ [ 23.119323] cloud-init[1271]: Traceback (most recent call last): [ 23.119359] cloud-init[1271]: File "/usr/lib/python3/dist-packages/cloudinit/cmd/main.py", line 653, in status_wrapperter: mua_client_restrictions Nov 16 17:42:35 node1 postmulti[1282]: /usr/sbin/postconf: warning: /etc/postfix/master.cf: undefined parameter: mua_helo_restrictions Nov 16 17:42:35 node1 postmulti[1282]: /usr/sbin/postconf: warning: /etc/postfix/master.cf: undefined parameter: mua_sender_restrictions Nov 16 17:42:35 node1 postmulti[1282]: /usr/sbin/postconf: warning: /etc/postfix/master.cf: undefined parameter: mua_client_restrictions Nov 16 17:42:35 node1 postmulti[1282]: /usr/sbin/postconf: warning: /etc/postfix/master.cf: undefined parameter: mua_helo_restrictions Nov 16 17:42:35 node1 postmulti[1282]: /usr/sbin/postconf: warning: /etc/postfix/master.cf: undefined parameter: mua_sender_restrictions Nov 16 17:42:35 node1 postmulti[1282]: /usr/sbin/postconf: warning: /etc/postfix/master.cf: undefined parameter: mua_client_restrictions Nov 16 17:42:35 node1 postmulti[1282]: /usr/sbin/postconf: warning: /etc/postfix/master.cf: undefined parameter: mua_helo_restrictions Nov 16 17:42:35 node1 postmulti[1282]: /usr/sbin/postconf: warning: /etc/postfix/master.cf: undefined parameter: mua_sender_restrictions Nov 16 17:42:35 node1 named[845]: zone mne---.com/IN: loaded serial 1572390203 Nov 16 17:42:35 node1 postmulti[1282]: /usr/sbin/postconf: warning: /etc/postfix/master.cf: undefined parameter: mua_client_restrictions Nov 16 17:42:35 node1 postmulti[1282]: /usr/sbin/postconf: warning: /etc/postfix/master.cf: undefined parameter: mua_helo_restrictions Nov 16 17:42:35 node1 postmulti[1282]: /usr/sbin/postconf: warning: /etc/postfix/master.cf: undefined parameter: mua_sender_restrictions Nov 16 17:42:35 node1 postmulti[1282]: /usr/sbin/postconf: warning: /etc/postfix/master.cf: undefined parameter: mua_client_restrictions Nov 16 17:42:35 node1 postmulti[1282]: /usr/sbin/postconf: warning: /etc/postfix/master.cf: undefined parameter: mua_helo_restrictions Nov 16 17:42:35 node1 postmulti[1282]: /usr/sbin/postconf: warning: /etc/postfix/master.cf: undefined parameter: mua_sender_restrictions Nov 16 17:42:35 node1 collectd[1184]: plugin_load: plugin "aggregation" successfully loaded. Nov 16 17:42:35 node1 postmulti[1282]: /usr/sbin/postconf: warning: /etc/postfix/master.cf: undefined parameter: mua_client_restrictions Nov 16 17:42:35 node1 postmulti[1282]: /usr/sbin/postconf: warning: /etc/postfix/master.cf: undefined parameter: mua_helo_restrictions Nov 16 17:42:35 node1 postmulti[1282]: /usr/sbin/postconf: warning: /etc/postfix/master.cf: undefined parameter: mua_sender_restrictions Nov 16 17:42:35 node1 postmulti[1282]: /usr/sbin/postconf: warning: /etc/postfix/master.cf: undefined parameter: mua_client_restrictions Nov 16 17:42:35 node1 postmulti[1282]: /usr/sbin/postconf: warning: /etc/postfix/master.cf: undefined parameter: mua_helo_restrictions Nov 16 17:42:35 node1 cloud-init[1271]: failed run of stage modules-config Nov 16 17:42:35 node1 cloud-init[1271]: ------------------------------------------------------------ Nov 16 17:42:35 node1 cloud-init[1271]: Traceback (most recent call last): Nov 16 17:42:35 node1 cloud-init[1271]: File "/usr/lib/python3/dist-packages/cloudinit/cmd/main.py", line 653, in status_wrapper [ 23.454443] cloud-init[1271]: ret = functor(name, args) [ 23.454496] cloud-init[1271]: File "/usr/lib/python3/dist-packages/cloudinit/cmd/main.py", line 485, in main_modules [ 23.454534] cloud-init[1271]: init.fetch(existing="trust") [ 23.454567] cloud-init[1271]: File "/usr/lib/python3/dist-packages/cloudinit/stages.py", line 352, in fetch [ 23.454600] cloud-init[1271]: return self._get_data_source(existing=existing) [ 23.454655] cloud-init[1271]: File "/usr/lib/python3/dist-packages/cloudinit/stages.py", line 253, in _get_data_source [ 23.790495] cloud-init[1271]: util.del_file(self.paths.instance_link) [ 23.790549] cloud-init[1271]: File "/usr/lib/python3/dist-packages/cloudinit/util.py", line 1780, in del_file [ 23.790585] cloud-init[1271]: raise e [ 23.790618] cloud-init[1271]: File "/usr/lib/python3/dist-packages/cloudinit/util.py", line 1777, in del_file [ 23.790652] cloud-init[1271]: os.unlink(path) [ 23.790710] cloud-init[1271]: IsADirectoryError: [Errno 21] Is a directory: '/var/lib/cloud/instance' [ 23.790782] cloud-init[1271]: ------------------------------------------------------------ Nov 16 17:42:36 node1 cloud-init[1271]: ret = functor(name, args) Nov 16 17:42:36 node1 cloud-init[1271]: File "/usr/lib/python3/dist-packages/cloudinit/cmd/main.py", line 485, in main_modules Nov 16 17:42:36 node1 cloud-init[1271]: init.fetch(existing="trust") Nov 16 17:42:36 node1 cloud-init[1271]: File "/usr/lib/python3/dist-packages/cloudinit/stages.py", line 352, in fetch Nov 16 17:42:36 node1 cloud-init[1271]: return self._get_data_source(existing=existing) Nov 16 17:42:36 node1 cloud-init[1271]: File "/usr/lib/python3/dist-packages/cloudinit/stages.py", line 253, in _get_data_source Nov 16 17:42:36 node1 kernel: [ 23.767386] audit: type=1400 audit(1573944156.331:28): apparmor="DENIED" operation="open" profile="/usr/sbin/mysqld" name="/sys/devices/system/node/" pid=1092 comm="mysqld" requested_mask="r" denied_mask="r" fsuid=0 ouid=0 Nov 16 17:42:36 node1 cloud-init[1271]: util.del_file(self.paths.instance_link) Nov 16 17:42:36 node1 cloud-init[1271]: File "/usr/lib/python3/dist-packages/cloudinit/util.py", line 1780, in del_file Nov 16 17:42:36 node1 cloud-init[1271]: raise e Nov 16 17:42:36 node1 cloud-init[1271]: File "/usr/lib/python3/dist-packages/cloudinit/util.py", line 1777, in del_file Nov 16 17:42:36 node1 cloud-init[1271]: os.unlink(path) Nov 16 17:42:36 node1 cloud-init[1271]: IsADirectoryError: [Errno 21] Is a directory: '/var/lib/cloud/instance' Nov 16 17:42:36 node1 cloud-init[1271]: ------------------------------------------------------------ Nov 16 17:42:36 node1 proftpd[851]: 2019-11-16 17:42:35,613 node1.is.hostServer.ca proftpd[922]: mod_dso/0.5: module 'mod_tls.c' already loaded Nov 16 17:42:36 node1 proftpd[851]: 2019-11-16 17:42:35,798 node1.is.hostServer.ca proftpd[922]: mod_dso/0.5: module 'mod_sftp.c' already loaded Nov 16 17:42:36 node1 freshclam[536]: Sat Nov 16 17:42:36 2019 -> ^Can't query current.cvd.clamav.net Nov 16 17:42:36 node1 freshclam[536]: Sat Nov 16 17:42:36 2019 -> ^Invalid DNS reply. Falling back to HTTP mode. Nov 16 17:42:36 node1 freshclam[536]: Sat Nov 16 17:42:36 2019 -> Reading CVD header (main.cvd): Sat Nov 16 17:42:36 2019 -> ^Can't get information about db.local.clamav.net: Temporary failure in name resolution Nov 16 17:42:36 node1 freshclam[536]: Sat Nov 16 17:42:36 2019 -> ^Can't read main.cvd header from db.local.clamav.net (IP: ) Nov 16 17:42:36 node1 freshclam[536]: Sat Nov 16 17:42:36 2019 -> Trying again in 5 secs... Nov 16 17:42:36 node1 systemd[1]: Started LSB: start and stop Stackdriver Agent. Nov 16 17:42:36 node1 stackdriver-agent[847]: * The instance has neither the application default credentials file nor the correct monitoring scopes; Exiting. Nov 16 17:42:36 node1 stackdriver-agent[847]: * Not starting, configuration/credentials error. Nov 16 17:42:36 node1 stackdriver-agent[847]: ...fail! Nov 16 17:42:36 node1 postmulti[1282]: /usr/sbin/postconf: warning: /etc/postfix/master.cf: undefined parameter: mua_sender_restrictions Nov 16 17:42:36 node1 postmulti[1282]: /usr/sbin/postconf: warning: /etc/postfix/master.cf: undefined parameter: mua_client_restrictions Nov 16 17:42:36 node1 postmulti[1282]: /usr/sbin/postconf: warning: /etc/postfix/master.cf: undefined parameter: mua_helo_restrictions Nov 16 17:42:36 node1 postmulti[1282]: /usr/sbin/postconf: warning: /etc/postfix/master.cf: undefined parameter: mua_sender_restrictions Nov 16 17:42:36 node1 postmulti[1282]: /usr/sbin/postconf: warning: /etc/postfix/master.cf: undefined parameter: mua_client_restrictions Nov 16 17:42:36 node1 postmulti[1282]: /usr/sbin/postconf: warning: /etc/postfix/master.cf: undefined parameter: mua_helo_restrictions Nov 16 17:42:36 node1 named[845]: zone kil--.ca/IN: loaded serial 1572388749 Nov 16 17:42:36 node1 systemd[1]: cloud-config.service: Main process exited, code=exited, status=1/FAILURE Nov 16 17:42:36 node1 postmulti[1282]: /usr/sbin/postconf: warning: /etc/postfix/master.cf: undefined parameter: mua_sender_restrictions Nov 16 17:42:36 node1 postmulti[1282]: /usr/sbin/postconf: warning: /etc/postfix/master.cf: undefined parameter: mua_client_restrictions Nov 16 17:42:36 node1 postmulti[1282]: /usr/sbin/postconf: warning: /etc/postfix/master.cf: undefined parameter: mua_helo_restrictions Nov 16 17:42:36 node1 postmulti[1282]: /usr/sbin/postconf: warning: /etc/postfix/master.cf: undefined parameter: mua_sender_restrictions Nov 16 17:42:36 node1 postmulti[1282]: /usr/sbin/postconf: warning: /etc/postfix/master.cf: undefined parameter: mua_client_restrictions Nov 16 17:42:36 node1 postmulti[1282]: /usr/sbin/postconf: warning: /etc/postfix/master.cf: undefined parameter: mua_helo_restrictions Nov 16 17:42:36 node1 named[845]: zone sures----.ca/IN: loaded serial 1572390464 Nov 16 17:42:36 node1 systemd[1]: cloud-config.service: Failed with result 'exit-code'. Nov 16 17:42:36 node1 postmulti[1282]: /usr/sbin/postconf: warning: /etc/postfix/master.cf: undefined parameter: mua_sender_restrictions Nov 16 17:42:36 node1 postmulti[1282]: /usr/sbin/postconf: warning: /etc/postfix/master.cf: undefined parameter: mua_client_restrictions Nov 16 17:42:36 node1 postmulti[1282]: /usr/sbin/postconf: warning: /etc/postfix/master.cf: undefined parameter: mua_helo_restrictions Nov 16 17:42:36 node1 postmulti[1282]: /usr/sbin/postconf: warning: /etc/postfix/master.cf: undefined parameter: mua_sender_restrictions Nov 16 17:42:36 node1 postmulti[1282]: /usr/sbin/postconf: warning: /etc/postfix/master.cf: undefined parameter: mua_client_restrictions Nov 16 17:42:36 node1 postmulti[1282]: /usr/sbin/postconf: warning: /etc/postfix/master.cf: undefined parameter: mua_helo_restrictions Nov 16 17:42:36 node1 named[845]: zone t---.org/IN: loaded serial 1572390125 Nov 16 17:42:36 node1 systemd[1]: Failed to start Apply the settings specified in cloud-config. Nov 16 17:42:36 node1 postmulti[1282]: /usr/sbin/postconf: warning: /etc/postfix/master.cf: undefined parameter: mua_sender_restrictions Nov 16 17:42:36 node1 postmulti[1282]: /usr/sbin/postconf: warning: /etc/postfix/master.cf: undefined parameter: mua_client_restrictions Nov 16 17:42:36 node1 postmulti[1282]: /usr/sbin/postconf: warning: /etc/postfix/master.cf: undefined parameter: mua_helo_restrictions Nov 16 17:42:36 node1 postmulti[1282]: /usr/sbin/postconf: warning: /etc/postfix/master.cf: undefined parameter: mua_sender_restrictions Nov 16 17:42:36 node1 postmulti[1282]: /usr/sbin/postconf: warning: /etc/postfix/master.cf: undefined parameter: mua_client_restrictions Nov 16 17:42:36 node1 postmulti[1282]: /usr/sbin/postconf: warning: /etc/postfix/master.cf: undefined parameter: mua_helo_restrictions Nov 16 17:42:36 node1 named[845]: zone rod---------.com/IN: loaded serial 1572390327 Nov 16 17:42:36 node1 named[845]: zone localhost/IN: loaded serial 2 Nov 16 17:42:36 node1 named[845]: zone 255.in-addr.arpa/IN: loaded serial 1 Nov 16 17:42:36 node1 named[845]: zone comf----.ca/IN: loaded serial 1572390520 Nov 16 17:42:36 node1 named[845]: zone com----.ca/IN: loaded serial 1572390520 Nov 16 17:42:36 node1 named[845]: all zones loaded Nov 16 17:42:36 node1 named[845]: running Nov 16 17:42:36 node1 named[845]: network unreachable resolving './DNSKEY/IN': 2001:503:ba3e::2:30#53 Nov 16 17:42:36 node1 named[845]: network unreachable resolving './NS/IN': 2001:503:ba3e::2:30#53 Nov 16 17:42:36 node1 named[845]: network unreachable resolving './DNSKEY/IN': 2001:500:84::b#53 Nov 16 17:42:36 node1 named[845]: network unreachable resolving './NS/IN': 2001:500:84::b#53 Nov 16 17:42:36 node1 named[845]: network unreachable resolving './DNSKEY/IN': 2001:500:2::c#53 Nov 16 17:42:36 node1 named[845]: network unreachable resolving './NS/IN': 2001:500:2::c#53 Nov 16 17:42:36 node1 named[845]: network unreachable resolving './DNSKEY/IN': 2001:7fd::1#53 Nov 16 17:42:36 node1 named[845]: network unreachable resolving './NS/IN': 2001:7fd::1#53 Nov 16 17:42:36 node1 named[845]: network unreachable resolving './DNSKEY/IN': 2001:503:c27::2:30#53 Nov 16 17:42:36 node1 named[845]: network unreachable resolving './NS/IN': 2001:503:c27::2:30#53 Nov 16 17:42:36 node1 named[845]: network unreachable resolving './DNSKEY/IN': 2001:500:1::53#53 Nov 16 17:42:36 node1 named[845]: network unreachable resolving './NS/IN': 2001:500:1::53#53 Nov 16 17:42:36 node1 named[845]: network unreachable resolving './DNSKEY/IN': 2001:7fe::53#53 Nov 16 17:42:36 node1 named[845]: network unreachable resolving './NS/IN': 2001:7fe::53#53 Nov 16 17:42:36 node1 named[845]: network unreachable resolving './DNSKEY/IN': 2001:500:2f::f#53 Nov 16 17:42:36 node1 named[845]: network unreachable resolving './NS/IN': 2001:500:2f::f#53 Nov 16 17:42:36 node1 named[845]: network unreachable resolving './DNSKEY/IN': 2001:dc3::35#53 Nov 16 17:42:36 node1 named[845]: network unreachable resolving './NS/IN': 2001:dc3::35#53 Nov 16 17:42:36 node1 named[845]: network unreachable resolving './DNSKEY/IN': 2001:500:2d::d#53 Nov 16 17:42:36 node1 named[845]: network unreachable resolving './NS/IN': 2001:500:2d::d#53 Nov 16 17:42:36 node1 named[845]: network unreachable resolving './DNSKEY/IN': 2001:500:3::42#53 Nov 16 17:42:36 node1 named[845]: network unreachable resolving './NS/IN': 2001:500:3::42#53 Nov 16 17:42:36 node1 named[845]: network unreachable resolving './DNSKEY/IN': 192.112.36.4#53 Nov 16 17:42:36 node1 named[845]: network unreachable resolving './NS/IN': 192.112.36.4#53 Nov 16 17:42:36 node1 named[845]: network unreachable resolving './DNSKEY/IN': 192.203.230.10#53 Nov 16 17:42:36 node1 named[845]: network unreachable resolving './NS/IN': 192.203.230.10#53 Nov 16 17:42:36 node1 named[845]: network unreachable resolving './DNSKEY/IN': 198.41.0.4#53 Nov 16 17:42:36 node1 named[845]: network unreachable resolving './NS/IN': 198.41.0.4#53 Nov 16 17:42:36 node1 named[845]: network unreachable resolving './DNSKEY/IN': 192.228.79.201#53 Nov 16 17:42:36 node1 named[845]: network unreachable resolving './NS/IN': 192.228.79.201#53 Nov 16 17:42:36 node1 named[845]: network unreachable resolving './DNSKEY/IN': 192.33.4.12#53 Nov 16 17:42:36 node1 named[845]: network unreachable resolving './NS/IN': 192.33.4.12#53 Nov 16 17:42:36 node1 named[845]: network unreachable resolving './DNSKEY/IN': 193.0.14.129#53 Nov 16 17:42:36 node1 named[845]: network unreachable resolving './NS/IN': 193.0.14.129#53 Nov 16 17:42:36 node1 named[845]: network unreachable resolving './DNSKEY/IN': 192.58.128.30#53 Nov 16 17:42:36 node1 named[845]: network unreachable resolving './NS/IN': 192.58.128.30#53 Nov 16 17:42:36 node1 named[845]: network unreachable resolving './DNSKEY/IN': 198.97.190.53#53 Nov 16 17:42:36 node1 named[845]: network unreachable resolving './NS/IN': 198.97.190.53#53 Nov 16 17:42:36 node1 named[845]: network unreachable resolving './DNSKEY/IN': 192.36.148.17#53 Nov 16 17:42:36 node1 named[845]: network unreachable resolving './NS/IN': 192.36.148.17#53 Nov 16 17:42:36 node1 named[845]: network unreachable resolving './DNSKEY/IN': 192.5.5.241#53 Nov 16 17:42:36 node1 named[845]: network unreachable resolving './NS/IN': 192.5.5.241#53 Nov 16 17:42:36 node1 named[845]: network unreachable resolving './DNSKEY/IN': 202.12.27.33#53 Nov 16 17:42:36 node1 named[845]: network unreachable resolving './NS/IN': 202.12.27.33#53 Nov 16 17:42:36 node1 named[845]: network unreachable resolving './DNSKEY/IN': 199.7.91.13#53 Nov 16 17:42:36 node1 named[845]: network unreachable resolving './NS/IN': 199.7.91.13#53 Nov 16 17:42:36 node1 named[845]: network unreachable resolving './DNSKEY/IN': 199.7.83.42#53 Nov 16 17:42:36 node1 named[845]: network unreachable resolving 'E.ROOT-SERVERS.NET/AAAA/IN': 2001:500:2d::d#53 Nov 16 17:42:36 node1 named[845]: network unreachable resolving 'E.ROOT-SERVERS.NET/AAAA/IN': 2001:dc3::35#53 Nov 16 17:42:36 node1 named[845]: network unreachable resolving 'G.ROOT-SERVERS.NET/AAAA/IN': 192.33.4.12#53 Nov 16 17:42:36 node1 named[845]: network unreachable resolving 'G.ROOT-SERVERS.NET/AAAA/IN': 2001:7fd::1#53 Nov 16 17:42:36 node1 named[845]: managed-keys-zone: Unable to fetch DNSKEY set '.': failure Nov 16 17:42:36 node1 named[845]: network unreachable resolving './NS/IN': 199.7.83.42#53 Nov 16 17:42:36 node1 named[845]: network unreachable resolving 'E.ROOT-SERVERS.NET/AAAA/IN': 192.33.4.12#53 Nov 16 17:42:36 node1 named[845]: network unreachable resolving 'E.ROOT-SERVERS.NET/AAAA/IN': 2001:7fd::1#53 Nov 16 17:42:36 node1 named[845]: network unreachable resolving 'E.ROOT-SERVERS.NET/AAAA/IN': 192.203.230.10#53 Nov 16 17:42:36 node1 named[845]: network unreachable resolving 'G.ROOT-SERVERS.NET/AAAA/IN': 202.12.27.33#53 Nov 16 17:42:36 node1 named[845]: network unreachable resolving 'G.ROOT-SERVERS.NET/AAAA/IN': 192.203.230.10#53 Nov 16 17:42:36 node1 named[845]: network unreachable resolving 'G.ROOT-SERVERS.NET/AAAA/IN': 2001:500:84::b#53 Nov 16 17:42:36 node1 named[845]: resolver priming query complete Nov 16 17:42:36 node1 named[845]: network unreachable resolving 'E.ROOT-SERVERS.NET/AAAA/IN': 2001:500:84::b#53 Nov 16 17:42:36 node1 named[845]: network unreachable resolving 'E.ROOT-SERVERS.NET/AAAA/IN': 2001:7fe::53#53 Nov 16 17:42:36 node1 named[845]: network unreachable resolving 'G.ROOT-SERVERS.NET/AAAA/IN': 199.7.91.13#53 Nov 16 17:42:36 node1 named[845]: network unreachable resolving 'G.ROOT-SERVERS.NET/AAAA/IN': 2001:7fe::53#53 Nov 16 17:42:36 node1 named[845]: network unreachable resolving 'E.ROOT-SERVERS.NET/AAAA/IN': 198.97.190.53#53 Nov 16 17:42:36 node1 named[845]: network unreachable resolving 'E.ROOT-SERVERS.NET/AAAA/IN': 2001:503:ba3e::2:30#53 Nov 16 17:42:36 node1 named[845]: network unreachable resolving 'E.ROOT-SERVERS.NET/AAAA/IN': 2001:500:3::42#53 Nov 16 17:42:36 node1 named[845]: network unreachable resolving 'G.ROOT-SERVERS.NET/AAAA/IN': 198.97.190.53#53 Nov 16 17:42:36 node1 named[845]: network unreachable resolving 'G.ROOT-SERVERS.NET/AAAA/IN': 2001:503:ba3e::2:30#53 Nov 16 17:42:36 node1 named[845]: network unreachable resolving 'G.ROOT-SERVERS.NET/AAAA/IN': 2001:500:3::42#53 Nov 16 17:42:36 node1 named[845]: network unreachable resolving 'E.ROOT-SERVERS.NET/AAAA/IN': 192.112.36.4#53 Nov 16 17:42:36 node1 named[845]: network unreachable resolving 'E.ROOT-SERVERS.NET/AAAA/IN': 192.5.5.241#53 Nov 16 17:42:36 node1 named[845]: network unreachable resolving 'G.ROOT-SERVERS.NET/AAAA/IN': 192.112.36.4#53 Nov 16 17:42:36 node1 named[845]: network unreachable resolving 'G.ROOT-SERVERS.NET/AAAA/IN': 192.5.5.241#53 Nov 16 17:42:36 node1 named[845]: network unreachable resolving 'E.ROOT-SERVERS.NET/AAAA/IN': 192.58.128.30#53 Nov 16 17:42:36 node1 named[845]: network unreachable resolving 'E.ROOT-SERVERS.NET/AAAA/IN': 199.7.91.13#53 Nov 16 17:42:36 node1 named[845]: network unreachable resolving 'E.ROOT-SERVERS.NET/AAAA/IN': 202.12.27.33#53 Nov 16 17:42:36 node1 named[845]: network unreachable resolving 'G.ROOT-SERVERS.NET/AAAA/IN': 192.58.128.30#53 Nov 16 17:42:36 node1 named[845]: network unreachable resolving 'G.ROOT-SERVERS.NET/AAAA/IN': 2001:500:2::c#53 Nov 16 17:42:36 node1 named[845]: network unreachable resolving 'G.ROOT-SERVERS.NET/AAAA/IN': 193.0.14.129#53 Nov 16 17:42:36 node1 named[845]: network unreachable resolving 'E.ROOT-SERVERS.NET/AAAA/IN': 2001:500:2::c#53 Nov 16 17:42:36 node1 named[845]: network unreachable resolving 'E.ROOT-SERVERS.NET/AAAA/IN': 193.0.14.129#53 Nov 16 17:42:36 node1 named[845]: network unreachable resolving 'G.ROOT-SERVERS.NET/AAAA/IN': 2001:dc3::35#53 Nov 16 17:42:36 node1 named[845]: network unreachable resolving 'G.ROOT-SERVERS.NET/AAAA/IN': 192.228.79.201#53 Nov 16 17:42:36 node1 named[845]: network unreachable resolving 'E.ROOT-SERVERS.NET/AAAA/IN': 192.228.79.201#53 Nov 16 17:42:36 node1 named[845]: network unreachable resolving 'E.ROOT-SERVERS.NET/AAAA/IN': 192.36.148.17#53 Nov 16 17:42:36 node1 named[845]: network unreachable resolving 'E.ROOT-SERVERS.NET/AAAA/IN': 2001:500:1::53#53 Nov 16 17:42:36 node1 named[845]: network unreachable resolving 'G.ROOT-SERVERS.NET/AAAA/IN': 2001:500:2d::d#53 Nov 16 17:42:36 node1 named[845]: network unreachable resolving 'G.ROOT-SERVERS.NET/AAAA/IN': 192.36.148.17#53 Nov 16 17:42:36 node1 named[845]: network unreachable resolving 'G.ROOT-SERVERS.NET/AAAA/IN': 2001:500:1::53#53 Nov 16 17:42:36 node1 named[845]: network unreachable resolving 'E.ROOT-SERVERS.NET/AAAA/IN': 198.41.0.4#53 Nov 16 17:42:36 node1 named[845]: network unreachable resolving 'E.ROOT-SERVERS.NET/AAAA/IN': 199.7.83.42#53 Nov 16 17:42:36 node1 named[845]: network unreachable resolving 'G.ROOT-SERVERS.NET/AAAA/IN': 198.41.0.4#53 Nov 16 17:42:36 node1 named[845]: network unreachable resolving 'G.ROOT-SERVERS.NET/AAAA/IN': 199.7.83.42#53 Nov 16 17:42:36 node1 named[845]: network unreachable resolving 'E.ROOT-SERVERS.NET/AAAA/IN': 2001:500:2f::f#53 Nov 16 17:42:36 node1 named[845]: network unreachable resolving 'E.ROOT-SERVERS.NET/AAAA/IN': 2001:503:c27::2:30#53 Nov 16 17:42:36 node1 named[845]: network unreachable resolving 'G.ROOT-SERVERS.NET/AAAA/IN': 2001:500:2f::f#53 Nov 16 17:42:36 node1 named[845]: network unreachable resolving 'G.ROOT-SERVERS.NET/AAAA/IN': 2001:503:c27::2:30#53 Nov 16 17:42:37 node1 instance-setup: ERROR GET request error retrieving metadata. . Nov 16 17:42:37 node1 postmulti[1282]: /usr/sbin/postconf: warning: /etc/postfix/master.cf: undefined parameter: mua_sender_restrictions Nov 16 17:42:37 node1 postmulti[1282]: /usr/sbin/postconf: warning: /etc/postfix/master.cf: undefined parameter: mua_client_restrictions Nov 16 17:42:37 node1 postmulti[1282]: /usr/sbin/postconf: warning: /etc/postfix/master.cf: undefined parameter: mua_helo_restrictions Nov 16 17:42:37 node1 postmulti[1282]: /usr/sbin/postconf: warning: /etc/postfix/master.cf: undefined parameter: mua_sender_restrictions Nov 16 17:42:37 node1 postmulti[1282]: /usr/sbin/postconf: warning: /etc/postfix/master.cf: undefined parameter: mua_client_restrictions Nov 16 17:42:37 node1 postmulti[1282]: /usr/sbin/postconf: warning: /etc/postfix/master.cf: undefined parameter: mua_helo_restrictions Nov 16 17:42:39 node1 systemd[1]: Started Postfix Mail Transport Agent (instance -). Nov 16 17:42:39 node1 systemd[1]: Starting Postfix Mail Transport Agent... Nov 16 17:42:39 node1 systemd[1]: Started Postfix Mail Transport Agent. Nov 16 17:42:39 node1 fail2ban-server[852]: Server ready Nov 16 17:42:39 node1 kernel: [ 27.203427] audit: type=1400 audit(1573944159.767:29): apparmor="DENIED" operation="capable" profile="/usr/sbin/mysqld" pid=1092 comm="mysqld" capability=2 capname="dac_read_search" Nov 16 17:42:40 node1 systemd[1]: Started The PHP 7.3 FastCGI Process Manager. Nov 16 17:42:41 node1 freshclam[536]: Sat Nov 16 17:42:41 2019 -> ^Can't query current.cvd.clamav.net Nov 16 17:42:41 node1 freshclam[536]: Sat Nov 16 17:42:41 2019 -> ^Invalid DNS reply. Falling back to HTTP mode. Nov 16 17:42:41 node1 freshclam[536]: Sat Nov 16 17:42:41 2019 -> Reading CVD header (main.cvd): Sat Nov 16 17:42:41 2019 -> ^Can't get information about db.local.clamav.net: Temporary failure in name resolution Nov 16 17:42:41 node1 freshclam[536]: Sat Nov 16 17:42:41 2019 -> ^Can't read main.cvd header from db.local.clamav.net (IP: ) Nov 16 17:42:41 node1 freshclam[536]: Sat Nov 16 17:42:41 2019 -> Trying again in 5 secs... Nov 16 17:42:41 node1 postgrey[812]: whitelisted: 66.216.126.174/32 Nov 16 17:42:41 node1 postgrey[812]: whitelisted: 193.77.153.67/32 Nov 16 17:42:41 node1 postgrey[812]: whitelisted 2: 195.235.39.0/24 Nov 16 17:42:41 node1 postgrey[812]: whitelisted: 216.238.112.99/32 Nov 16 17:42:41 node1 postgrey[812]: whitelisted: 193.81.20.195/32 Nov 16 17:42:41 node1 postgrey[812]: whitelisted: 193.77.126.208/32 Nov 16 17:42:41 node1 postgrey[812]: whitelisted: 80.200.249.216/32 Nov 16 17:42:41 node1 postgrey[812]: whitelisted: 193.191.218.141/32 Nov 16 17:42:41 node1 postgrey[812]: whitelisted: 193.191.218.142/32 Nov 16 17:42:41 node1 postgrey[812]: whitelisted: 193.191.218.143/32 Nov 16 17:42:41 node1 postgrey[812]: whitelisted: 194.7.234.141/32 Nov 16 17:42:41 node1 postgrey[812]: whitelisted: 194.7.234.142/32 Nov 16 17:42:41 node1 postgrey[812]: whitelisted: 194.7.234.143/32 Nov 16 17:42:41 node1 postgrey[812]: whitelisted: 213.143.66.210/32 Nov 16 17:42:41 node1 postgrey[812]: ...done. Nov 16 17:42:41 node1 systemd[1]: Started LSB: Start/stop the postgrey daemon. Nov 16 17:42:41 node1 kernel: [ 29.010572] audit: type=1400 audit(1573944161.575:30): apparmor="DENIED" operation="open" profile="/usr/sbin/mysqld" name="/sys/devices/system/node/" pid=1572 comm="mysqld" requested_mask="r" denied_mask="r" fsuid=111 ouid=0 Nov 16 17:42:41 node1 systemd[1]: Started The PHP 7.2 FastCGI Process Manager. Nov 16 17:42:44 node1 systemd[1]: Started The Apache HTTP Server. Nov 16 17:42:44 node1 systemd[1]: Started The PHP 5.6 FastCGI Process Manager. Nov 16 17:42:46 node1 freshclam[536]: Sat Nov 16 17:42:46 2019 -> ^Can't query current.cvd.clamav.net Nov 16 17:42:46 node1 freshclam[536]: Sat Nov 16 17:42:46 2019 -> ^Invalid DNS reply. Falling back to HTTP mode. Nov 16 17:42:46 node1 freshclam[536]: Sat Nov 16 17:42:46 2019 -> Reading CVD header (main.cvd): Sat Nov 16 17:42:46 2019 -> !Can't get information about db.local.clamav.net: Temporary failure in name resolution Nov 16 17:42:46 node1 freshclam[536]: Sat Nov 16 17:42:46 2019 -> ^Can't read main.cvd header from db.local.clamav.net (IP: ) Nov 16 17:42:46 node1 freshclam[536]: Sat Nov 16 17:42:46 2019 -> Giving up on db.local.clamav.net... Nov 16 17:42:46 node1 freshclam[536]: Sat Nov 16 17:42:46 2019 -> ^Can't query current.cvd.clamav.net Nov 16 17:42:46 node1 freshclam[536]: Sat Nov 16 17:42:46 2019 -> ^Invalid DNS reply. Falling back to HTTP mode. Nov 16 17:42:46 node1 freshclam[536]: Sat Nov 16 17:42:46 2019 -> Reading CVD header (main.cvd): Sat Nov 16 17:42:46 2019 -> ^Can't get information about database.clamav.net: Temporary failure in name resolution Nov 16 17:42:46 node1 freshclam[536]: Sat Nov 16 17:42:46 2019 -> ^Can't read main.cvd header from database.clamav.net (IP: ) Nov 16 17:42:46 node1 systemd[1]: Started Clean php session files. Nov 16 17:42:46 node1 freshclam[536]: Sat Nov 16 17:42:46 2019 -> Trying again in 5 secs... Nov 16 17:42:48 node1 systemd[1]: Started LSB: web-based account administration interface for Unix systems. Nov 16 17:42:49 node1 proftpd[851]: ...done. Nov 16 17:42:49 node1 systemd[1]: Started LSB: Starts ProFTPD daemon. Nov 16 17:42:51 node1 freshclam[536]: Sat Nov 16 17:42:51 2019 -> ^Can't query current.cvd.clamav.net Nov 16 17:42:51 node1 freshclam[536]: Sat Nov 16 17:42:51 2019 -> ^Invalid DNS reply. Falling back to HTTP mode. Nov 16 17:42:51 node1 freshclam[536]: Sat Nov 16 17:42:51 2019 -> Reading CVD header (main.cvd): Sat Nov 16 17:42:51 2019 -> ^Can't get information about database.clamav.net: Temporary failure in name resolution Nov 16 17:42:51 node1 freshclam[536]: Sat Nov 16 17:42:51 2019 -> ^Can't read main.cvd header from database.clamav.net (IP: ) Nov 16 17:42:51 node1 freshclam[536]: Sat Nov 16 17:42:51 2019 -> Trying again in 5 secs... Nov 16 17:42:52 node1 systemd[1]: Started LSB: web-based administration interface for Unix systems. Nov 16 17:42:52 node1 snapd[553]: autorefresh.go:385: Cannot prepare auto-refresh change due to a permanent network error: persistent network error: Get https://api.snapcraft.io/api/v1/snaps/assertions/snap-declaration/16/MJbt3BgxESyOON7gqKVEnA06NLRM3Dxd?max-format=3: dial tcp: lookup api.snapcraft.io: Temporary failure in name resolution Nov 16 17:42:55 node1 systemd[1]: Started MySQL Community Server. Nov 16 17:42:56 node1 freshclam[536]: Sat Nov 16 17:42:56 2019 -> ^Can't query current.cvd.clamav.net Nov 16 17:42:56 node1 freshclam[536]: Sat Nov 16 17:42:56 2019 -> ^Invalid DNS reply. Falling back to HTTP mode. Nov 16 17:42:56 node1 freshclam[536]: Sat Nov 16 17:42:56 2019 -> Reading CVD header (main.cvd): Sat Nov 16 17:42:56 2019 -> ^Can't get information about database.clamav.net: Temporary failure in name resolution Nov 16 17:42:56 node1 freshclam[536]: Sat Nov 16 17:42:56 2019 -> ^Can't read main.cvd header from database.clamav.net (IP: ) Nov 16 17:42:56 node1 freshclam[536]: Sat Nov 16 17:42:56 2019 -> Trying again in 5 secs... Nov 16 17:43:01 node1 freshclam[536]: Sat Nov 16 17:43:01 2019 -> ^Can't query current.cvd.clamav.net Nov 16 17:43:01 node1 freshclam[536]: Sat Nov 16 17:43:01 2019 -> ^Invalid DNS reply. Falling back to HTTP mode. Nov 16 17:43:01 node1 freshclam[536]: Sat Nov 16 17:43:01 2019 -> Reading CVD header (main.cvd): Sat Nov 16 17:43:01 2019 -> ^Can't get information about database.clamav.net: Temporary failure in name resolution Nov 16 17:43:01 node1 freshclam[536]: Sat Nov 16 17:43:01 2019 -> ^Can't read main.cvd header from database.clamav.net (IP: ) Nov 16 17:43:01 node1 freshclam[536]: Sat Nov 16 17:43:01 2019 -> Trying again in 5 secs... Nov 16 17:43:06 node1 freshclam[536]: Sat Nov 16 17:43:06 2019 -> ^Can't query current.cvd.clamav.net Nov 16 17:43:06 node1 freshclam[536]: Sat Nov 16 17:43:06 2019 -> ^Invalid DNS reply. Falling back to HTTP mode. Nov 16 17:43:06 node1 freshclam[536]: Sat Nov 16 17:43:06 2019 -> Reading CVD header (main.cvd): Sat Nov 16 17:43:06 2019 -> !Can't get information about database.clamav.net: Temporary failure in name resolution Nov 16 17:43:06 node1 freshclam[536]: Sat Nov 16 17:43:06 2019 -> ^Can't read main.cvd header from database.clamav.net (IP: ) Nov 16 17:43:06 node1 freshclam[536]: Sat Nov 16 17:43:06 2019 -> Giving up on database.clamav.net... Nov 16 17:43:06 node1 freshclam[536]: Sat Nov 16 17:43:06 2019 -> Update failed. Your network may be down or none of the mirrors listed in /etc/clamav/freshclam.conf is working. Check https://www.clamav.net/documents/official-mirror-faq for possible reasons. Nov 16 17:43:15 node1 snapd[553]: stateengine.go:150: state ensure error: persistent network error: Get https://api.snapcraft.io/api/v1/snaps/assertions/snap-declaration/16/MJbt3BgxESyOON7gqKVEnA06NLRM3Dxd?max-format=3: dial tcp: lookup api.snapcraft.io: Temporary failure in name resolution Nov 16 17:43:48 node1 systemd[1]: Created slice User Slice of hostedUser. Nov 16 17:43:48 node1 systemd[1]: Starting User Manager for UID 1006... Nov 16 17:43:48 node1 systemd[1]: Started Session c1 of user hostedUser. Nov 16 17:43:49 node1 systemd[3310]: gpg-agent-browser.socket: Socket service gpg-agent.service not loaded, refusing. Nov 16 17:43:49 node1 systemd[3310]: Failed to listen on GnuPG cryptographic agent and passphrase cache (access for web browsers). Nov 16 17:43:49 node1 systemd[3310]: Reached target Timers. Nov 16 17:43:49 node1 systemd[3310]: dirmngr.socket: Socket service dirmngr.service not loaded, refusing. Nov 16 17:43:49 node1 systemd[3310]: Failed to listen on GnuPG network certificate management daemon. Nov 16 17:43:49 node1 systemd[3310]: gpg-agent.socket: Socket service gpg-agent.service not loaded, refusing. Nov 16 17:43:49 node1 systemd[3310]: Failed to listen on GnuPG cryptographic agent and passphrase cache. Nov 16 17:43:49 node1 systemd[3310]: gpg-agent-ssh.socket: Socket service gpg-agent.service not loaded, refusing. Nov 16 17:43:49 node1 systemd[3310]: Failed to listen on GnuPG cryptographic agent (ssh-agent emulation). Nov 16 17:43:49 node1 systemd[3310]: gpg-agent-extra.socket: Socket service gpg-agent.service not loaded, refusing. Nov 16 17:43:49 node1 systemd[3310]: Failed to listen on GnuPG cryptographic agent and passphrase cache (restricted). Nov 16 17:43:49 node1 systemd[3310]: Reached target Sockets. Nov 16 17:43:49 node1 systemd[3310]: Reached target Paths. Nov 16 17:43:49 node1 systemd[3310]: Reached target Basic System. Nov 16 17:43:49 node1 systemd[3310]: Reached target Default. Nov 16 17:43:49 node1 systemd[3310]: Startup finished in 86ms. Nov 16 17:43:49 node1 systemd[1]: Started User Manager for UID 1006. Nov 16 17:43:49 node1 systemd[1]: Stopping User Manager for UID 1006... Nov 16 17:43:49 node1 systemd[3310]: Failed to enqueue exit.target job: Access denied Nov 16 17:43:49 node1 systemd[1]: Started Session c2 of user hostedUser. Nov 16 17:43:54 node1 systemd[1]: user@1006.service: State 'stop-sigterm' timed out. Killing. Nov 16 17:43:54 node1 systemd[1]: user@1006.service: Killing process 3310 (systemd) with signal SIGKILL. Nov 16 17:43:54 node1 systemd[1]: user@1006.service: Failed with result 'timeout'. Nov 16 17:43:54 node1 systemd[1]: Starting User Manager for UID 1006... Nov 16 17:43:54 node1 systemd[3337]: gpg-agent-browser.socket: Socket service gpg-agent.service not loaded, refusing. Nov 16 17:43:54 node1 systemd[3337]: Failed to listen on GnuPG cryptographic agent and passphrase cache (access for web browsers). Nov 16 17:43:54 node1 systemd[3337]: dirmngr.socket: Socket service dirmngr.service not loaded, refusing. Nov 16 17:43:54 node1 systemd[3337]: Failed to listen on GnuPG network certificate management daemon. Nov 16 17:43:54 node1 systemd[3337]: Reached target Timers. Nov 16 17:43:54 node1 systemd[3337]: gpg-agent-extra.socket: Socket service gpg-agent.service not loaded, refusing. Nov 16 17:43:54 node1 systemd[3337]: Failed to listen on GnuPG cryptographic agent and passphrase cache (restricted). Nov 16 17:43:54 node1 systemd[3337]: Reached target Paths. Nov 16 17:43:54 node1 systemd[3337]: gpg-agent-ssh.socket: Socket service gpg-agent.service not loaded, refusing. Nov 16 17:43:54 node1 systemd[3337]: Failed to listen on GnuPG cryptographic agent (ssh-agent emulation). Nov 16 17:43:54 node1 systemd[3337]: gpg-agent.socket: Socket service gpg-agent.service not loaded, refusing. Nov 16 17:43:54 node1 systemd[3337]: Failed to listen on GnuPG cryptographic agent and passphrase cache. Nov 16 17:43:54 node1 systemd[3337]: Reached target Sockets. Nov 16 17:43:54 node1 systemd[3337]: Reached target Basic System. Nov 16 17:43:54 node1 systemd[1]: Started User Manager for UID 1006. Nov 16 17:43:54 node1 systemd[3337]: Reached target Default. Nov 16 17:43:54 node1 systemd[3337]: Startup finished in 50ms. Nov 16 17:43:54 node1 systemd[1]: Stopping User Manager for UID 1006... Nov 16 17:43:54 node1 systemd[3337]: Failed to enqueue exit.target job: Access denied Nov 16 17:43:54 node1 systemd[1]: Started Session c3 of user hostedUser. Nov 16 17:43:59 node1 systemd[1]: user@1006.service: State 'stop-sigterm' timed out. Killing. Nov 16 17:43:59 node1 systemd[1]: user@1006.service: Killing process 3337 (systemd) with signal SIGKILL. Nov 16 17:43:59 node1 systemd[1]: user@1006.service: Failed with result 'timeout'. Nov 16 17:43:59 node1 systemd[1]: Starting User Manager for UID 1006... Nov 16 17:43:59 node1 systemd[3352]: gpg-agent-extra.socket: Socket service gpg-agent.service not loaded, refusing. Nov 16 17:43:59 node1 systemd[3352]: Failed to listen on GnuPG cryptographic agent and passphrase cache (restricted). Nov 16 17:43:59 node1 systemd[3352]: gpg-agent-browser.socket: Socket service gpg-agent.service not loaded, refusing. Nov 16 17:43:59 node1 systemd[3352]: Failed to listen on GnuPG cryptographic agent and passphrase cache (access for web browsers). Nov 16 17:43:59 node1 systemd[3352]: Reached target Timers. Nov 16 17:43:59 node1 systemd[3352]: Reached target Paths. Nov 16 17:43:59 node1 systemd[3352]: dirmngr.socket: Socket service dirmngr.service not loaded, refusing. Nov 16 17:43:59 node1 systemd[3352]: Failed to listen on GnuPG network certificate management daemon. Nov 16 17:43:59 node1 systemd[3352]: gpg-agent.socket: Socket service gpg-agent.service not loaded, refusing. Nov 16 17:43:59 node1 systemd[3352]: Failed to listen on GnuPG cryptographic agent and passphrase cache. Nov 16 17:43:59 node1 systemd[3352]: gpg-agent-ssh.socket: Socket service gpg-agent.service not loaded, refusing. Nov 16 17:43:59 node1 systemd[3352]: Failed to listen on GnuPG cryptographic agent (ssh-agent emulation). Nov 16 17:43:59 node1 systemd[3352]: Reached target Sockets. Nov 16 17:43:59 node1 systemd[3352]: Reached target Basic System. Nov 16 17:43:59 node1 systemd[1]: Started User Manager for UID 1006. Nov 16 17:43:59 node1 systemd[3352]: Reached target Default. Nov 16 17:43:59 node1 systemd[3352]: Startup finished in 47ms. Nov 16 17:43:59 node1 systemd[1]: Stopping User Manager for UID 1006... Nov 16 17:43:59 node1 systemd[3352]: Failed to enqueue exit.target job: Access denied Nov 16 17:43:59 node1 systemd[1]: Started Session c4 of user hostedUser. Nov 16 17:43:59 node1 clamd[561]: Sat Nov 16 17:43:59 2019 -> Limits: Global time limit set to 120000 milliseconds. Nov 16 17:43:59 node1 clamd[561]: Sat Nov 16 17:43:59 2019 -> Limits: Global size limit set to 104857600 bytes. Nov 16 17:43:59 node1 clamd[561]: Sat Nov 16 17:43:59 2019 -> Limits: File size limit set to 26214400 bytes. Nov 16 17:43:59 node1 clamd[561]: Sat Nov 16 17:43:59 2019 -> Limits: Recursion level limit set to 16. Nov 16 17:43:59 node1 clamd[561]: Sat Nov 16 17:43:59 2019 -> Limits: Files limit set to 10000. Nov 16 17:43:59 node1 clamd[561]: Sat Nov 16 17:43:59 2019 -> Limits: MaxEmbeddedPE limit set to 10485760 bytes. Nov 16 17:43:59 node1 clamd[561]: Sat Nov 16 17:43:59 2019 -> Limits: MaxHTMLNormalize limit set to 10485760 bytes. Nov 16 17:43:59 node1 clamd[561]: Sat Nov 16 17:43:59 2019 -> Limits: MaxHTMLNoTags limit set to 2097152 bytes. Nov 16 17:43:59 node1 clamd[561]: Sat Nov 16 17:43:59 2019 -> Limits: MaxScriptNormalize limit set to 5242880 bytes. Nov 16 17:43:59 node1 clamd[561]: Sat Nov 16 17:43:59 2019 -> Limits: MaxZipTypeRcg limit set to 1048576 bytes. Nov 16 17:43:59 node1 clamd[561]: Sat Nov 16 17:43:59 2019 -> Limits: MaxPartitions limit set to 50. Nov 16 17:43:59 node1 clamd[561]: Sat Nov 16 17:43:59 2019 -> Limits: MaxIconsPE limit set to 100. Nov 16 17:43:59 node1 clamd[561]: Sat Nov 16 17:43:59 2019 -> Limits: MaxRecHWP3 limit set to 16. Nov 16 17:43:59 node1 clamd[561]: Sat Nov 16 17:43:59 2019 -> Limits: PCREMatchLimit limit set to 10000. Nov 16 17:43:59 node1 clamd[561]: Sat Nov 16 17:43:59 2019 -> Limits: PCRERecMatchLimit limit set to 5000. Nov 16 17:43:59 node1 clamd[561]: Sat Nov 16 17:43:59 2019 -> Limits: PCREMaxFileSize limit set to 26214400. Nov 16 17:43:59 node1 clamd[561]: Sat Nov 16 17:43:59 2019 -> Archive support enabled. Nov 16 17:43:59 node1 clamd[561]: Sat Nov 16 17:43:59 2019 -> AlertExceedsMax heuristic detection disabled. Nov 16 17:43:59 node1 clamd[561]: Sat Nov 16 17:43:59 2019 -> Heuristic alerts enabled. Nov 16 17:43:59 node1 clamd[561]: Sat Nov 16 17:43:59 2019 -> Portable Executable support enabled. Nov 16 17:43:59 node1 clamd[561]: Sat Nov 16 17:43:59 2019 -> ELF support enabled. Nov 16 17:43:59 node1 clamd[561]: Sat Nov 16 17:43:59 2019 -> Mail files support enabled. Nov 16 17:43:59 node1 clamd[561]: Sat Nov 16 17:43:59 2019 -> OLE2 support enabled. Nov 16 17:43:59 node1 clamd[561]: Sat Nov 16 17:43:59 2019 -> PDF support enabled. Nov 16 17:43:59 node1 clamd[561]: Sat Nov 16 17:43:59 2019 -> SWF support enabled. Nov 16 17:43:59 node1 clamd[561]: Sat Nov 16 17:43:59 2019 -> HTML support enabled. Nov 16 17:43:59 node1 clamd[561]: Sat Nov 16 17:43:59 2019 -> XMLDOCS support enabled. Nov 16 17:43:59 node1 clamd[561]: Sat Nov 16 17:43:59 2019 -> HWP3 support enabled. Nov 16 17:43:59 node1 clamd[561]: Sat Nov 16 17:43:59 2019 -> Self checking every 3600 seconds. Nov 16 17:44:04 node1 systemd[1]: user@1006.service: State 'stop-sigterm' timed out. Killing. Nov 16 17:44:04 node1 systemd[1]: user@1006.service: Killing process 3352 (systemd) with signal SIGKILL. Nov 16 17:44:04 node1 systemd[1]: user@1006.service: Failed with result 'timeout'. Nov 16 17:44:04 node1 systemd[1]: Starting User Manager for UID 1006... Nov 16 17:44:04 node1 systemd[3374]: Reached target Paths. Nov 16 17:44:04 node1 systemd[3374]: gpg-agent-extra.socket: Socket service gpg-agent.service not loaded, refusing. Nov 16 17:44:04 node1 systemd[3374]: Failed to listen on GnuPG cryptographic agent and passphrase cache (restricted). Nov 16 17:44:04 node1 systemd[3374]: gpg-agent.socket: Socket service gpg-agent.service not loaded, refusing. Nov 16 17:44:04 node1 systemd[3374]: Failed to listen on GnuPG cryptographic agent and passphrase cache. Nov 16 17:44:04 node1 systemd[3374]: gpg-agent-browser.socket: Socket service gpg-agent.service not loaded, refusing. Nov 16 17:44:04 node1 systemd[3374]: Failed to listen on GnuPG cryptographic agent and passphrase cache (access for web browsers). Nov 16 17:44:04 node1 systemd[3374]: gpg-agent-ssh.socket: Socket service gpg-agent.service not loaded, refusing. Nov 16 17:44:04 node1 systemd[3374]: Failed to listen on GnuPG cryptographic agent (ssh-agent emulation). Nov 16 17:44:04 node1 systemd[3374]: Reached target Timers. Nov 16 17:44:04 node1 systemd[3374]: dirmngr.socket: Socket service dirmngr.service not loaded, refusing. Nov 16 17:44:04 node1 systemd[3374]: Failed to listen on GnuPG network certificate management daemon. Nov 16 17:44:04 node1 systemd[3374]: Reached target Sockets. Nov 16 17:44:04 node1 systemd[3374]: Reached target Basic System. Nov 16 17:44:04 node1 systemd[1]: Started User Manager for UID 1006. Nov 16 17:44:04 node1 systemd[3374]: Reached target Default. Nov 16 17:44:04 node1 systemd[3374]: Startup finished in 27ms. Nov 16 17:44:04 node1 systemd[1]: Stopping User Manager for UID 1006... Nov 16 17:44:04 node1 systemd[3374]: Failed to enqueue exit.target job: Access denied Nov 16 17:44:09 node1 systemd[1]: user@1006.service: State 'stop-sigterm' timed out. Killing. Nov 16 17:44:09 node1 systemd[1]: user@1006.service: Killing process 3374 (systemd) with signal SIGKILL. Nov 16 17:44:09 node1 systemd[1]: user@1006.service: Failed with result 'timeout'. Nov 16 17:44:09 node1 systemd[1]: Stopped User Manager for UID 1006. Nov 16 17:44:09 node1 systemd[1]: Removed slice User Slice of hostedUser. Nov 16 17:48:11 node1 systemd[1]: Created slice User Slice of hostedUser. Nov 16 17:48:11 node1 systemd[1]: Starting User Manager for UID 1006... Nov 16 17:48:11 node1 systemd[1]: Started Session c5 of user hostedUser. Nov 16 17:48:11 node1 systemd[4727]: gpg-agent.socket: Socket service gpg-agent.service not loaded, refusing. Nov 16 17:48:11 node1 systemd[4727]: Failed to listen on GnuPG cryptographic agent and passphrase cache. Nov 16 17:48:11 node1 systemd[4727]: gpg-agent-ssh.socket: Socket service gpg-agent.service not loaded, refusing. Nov 16 17:48:11 node1 systemd[4727]: Failed to listen on GnuPG cryptographic agent (ssh-agent emulation). Nov 16 17:48:11 node1 systemd[4727]: Reached target Paths. Nov 16 17:48:11 node1 systemd[4727]: gpg-agent-browser.socket: Socket service gpg-agent.service not loaded, refusing. Nov 16 17:48:11 node1 systemd[4727]: Failed to listen on GnuPG cryptographic agent and passphrase cache (access for web browsers). Nov 16 17:48:11 node1 systemd[4727]: gpg-agent-extra.socket: Socket service gpg-agent.service not loaded, refusing. Nov 16 17:48:11 node1 systemd[4727]: Failed to listen on GnuPG cryptographic agent and passphrase cache (restricted). Nov 16 17:48:11 node1 systemd[4727]: dirmngr.socket: Socket service dirmngr.service not loaded, refusing. Nov 16 17:48:11 node1 systemd[4727]: Failed to listen on GnuPG network certificate management daemon. Nov 16 17:48:11 node1 systemd[4727]: Reached target Sockets. Nov 16 17:48:11 node1 systemd[4727]: Reached target Timers. Nov 16 17:48:11 node1 systemd[4727]: Reached target Basic System. Nov 16 17:48:11 node1 systemd[1]: Started User Manager for UID 1006. Nov 16 17:48:11 node1 systemd[4727]: Reached target Default. Nov 16 17:48:11 node1 systemd[4727]: Startup finished in 26ms. Nov 16 17:48:11 node1 systemd[1]: Stopping User Manager for UID 1006... Nov 16 17:48:11 node1 systemd[4727]: Failed to enqueue exit.target job: Access denied Nov 16 17:48:11 node1 systemd[1]: Started Session c6 of user hostedUser. Nov 16 17:48:16 node1 systemd[1]: user@1006.service: State 'stop-sigterm' timed out. Killing. Nov 16 17:48:16 node1 systemd[1]: user@1006.service: Killing process 4727 (systemd) with signal SIGKILL. Nov 16 17:48:16 node1 systemd[1]: user@1006.service: Failed with result 'timeout'. Nov 16 17:48:16 node1 systemd[1]: Starting User Manager for UID 1006... Nov 16 17:48:16 node1 systemd[4742]: gpg-agent-extra.socket: Socket service gpg-agent.service not loaded, refusing. Nov 16 17:48:16 node1 systemd[4742]: Failed to listen on GnuPG cryptographic agent and passphrase cache (restricted). Nov 16 17:48:16 node1 systemd[4742]: gpg-agent-ssh.socket: Socket service gpg-agent.service not loaded, refusing. Nov 16 17:48:16 node1 systemd[4742]: Failed to listen on GnuPG cryptographic agent (ssh-agent emulation). Nov 16 17:48:16 node1 systemd[4742]: dirmngr.socket: Socket service dirmngr.service not loaded, refusing. Nov 16 17:48:16 node1 systemd[4742]: Failed to listen on GnuPG network certificate management daemon. Nov 16 17:48:16 node1 systemd[4742]: Reached target Timers. Nov 16 17:48:16 node1 systemd[4742]: Reached target Paths. Nov 16 17:48:16 node1 systemd[4742]: gpg-agent.socket: Socket service gpg-agent.service not loaded, refusing. Nov 16 17:48:16 node1 systemd[4742]: Failed to listen on GnuPG cryptographic agent and passphrase cache. Nov 16 17:48:16 node1 systemd[4742]: gpg-agent-browser.socket: Socket service gpg-agent.service not loaded, refusing. Nov 16 17:48:16 node1 systemd[4742]: Failed to listen on GnuPG cryptographic agent and passphrase cache (access for web browsers). Nov 16 17:48:16 node1 systemd[4742]: Reached target Sockets. Nov 16 17:48:16 node1 systemd[4742]: Reached target Basic System. Nov 16 17:48:16 node1 systemd[1]: Started User Manager for UID 1006. Nov 16 17:48:16 node1 systemd[4742]: Reached target Default. Nov 16 17:48:16 node1 systemd[4742]: Startup finished in 27ms. Nov 16 17:48:16 node1 systemd[1]: Stopping User Manager for UID 1006... Nov 16 17:48:16 node1 systemd[4742]: Failed to enqueue exit.target job: Access denied Nov 16 17:48:16 node1 systemd[1]: Started Session c7 of user hostedUser. Nov 16 17:48:22 node1 systemd[1]: user@1006.service: State 'stop-sigterm' timed out. Killing. Nov 16 17:48:22 node1 systemd[1]: user@1006.service: Killing process 4742 (systemd) with signal SIGKILL. Nov 16 17:48:22 node1 systemd[1]: user@1006.service: Failed with result 'timeout'. Nov 16 17:48:22 node1 systemd[1]: Starting User Manager for UID 1006... Nov 16 17:48:22 node1 systemd[4757]: Reached target Paths. Nov 16 17:48:22 node1 systemd[4757]: gpg-agent-extra.socket: Socket service gpg-agent.service not loaded, refusing. Nov 16 17:48:22 node1 systemd[4757]: Failed to listen on GnuPG cryptographic agent and passphrase cache (restricted). Nov 16 17:48:22 node1 systemd[4757]: gpg-agent.socket: Socket service gpg-agent.service not loaded, refusing. Nov 16 17:48:22 node1 systemd[4757]: Failed to listen on GnuPG cryptographic agent and passphrase cache. Nov 16 17:48:22 node1 systemd[4757]: gpg-agent-browser.socket: Socket service gpg-agent.service not loaded, refusing. Nov 16 17:48:22 node1 systemd[4757]: Failed to listen on GnuPG cryptographic agent and passphrase cache (access for web browsers). Nov 16 17:48:22 node1 systemd[4757]: gpg-agent-ssh.socket: Socket service gpg-agent.service not loaded, refusing. Nov 16 17:48:22 node1 systemd[4757]: Failed to listen on GnuPG cryptographic agent (ssh-agent emulation). Nov 16 17:48:22 node1 systemd[4757]: Reached target Timers. Nov 16 17:48:22 node1 systemd[4757]: dirmngr.socket: Socket service dirmngr.service not loaded, refusing. Nov 16 17:48:22 node1 systemd[4757]: Failed to listen on GnuPG network certificate management daemon. Nov 16 17:48:22 node1 systemd[4757]: Reached target Sockets. Nov 16 17:48:22 node1 systemd[4757]: Reached target Basic System. Nov 16 17:48:22 node1 systemd[1]: Started User Manager for UID 1006. Nov 16 17:48:22 node1 systemd[4757]: Reached target Default. Nov 16 17:48:22 node1 systemd[4757]: Startup finished in 29ms. Nov 16 17:48:22 node1 systemd[1]: Stopping User Manager for UID 1006... Nov 16 17:48:22 node1 systemd[4757]: Failed to enqueue exit.target job: Access denied Nov 16 17:48:22 node1 systemd[1]: Started Session c8 of user hostedUser. Nov 16 17:48:27 node1 systemd[1]: user@1006.service: State 'stop-sigterm' timed out. Killing. Nov 16 17:48:27 node1 systemd[1]: user@1006.service: Killing process 4757 (systemd) with signal SIGKILL. Nov 16 17:48:27 node1 systemd[1]: user@1006.service: Failed with result 'timeout'. Nov 16 17:48:27 node1 systemd[1]: Starting User Manager for UID 1006... Nov 16 17:48:27 node1 systemd[4772]: dirmngr.socket: Socket service dirmngr.service not loaded, refusing. Nov 16 17:48:27 node1 systemd[4772]: Failed to listen on GnuPG network certificate management daemon. Nov 16 17:48:27 node1 systemd[4772]: gpg-agent-browser.socket: Socket service gpg-agent.service not loaded, refusing. Nov 16 17:48:27 node1 systemd[4772]: Failed to listen on GnuPG cryptographic agent and passphrase cache (access for web browsers). Nov 16 17:48:27 node1 systemd[4772]: gpg-agent-extra.socket: Socket service gpg-agent.service not loaded, refusing. Nov 16 17:48:27 node1 systemd[4772]: Failed to listen on GnuPG cryptographic agent and passphrase cache (restricted). Nov 16 17:48:27 node1 systemd[4772]: Reached target Timers. Nov 16 17:48:27 node1 systemd[4772]: Reached target Paths. Nov 16 17:48:27 node1 systemd[4772]: gpg-agent.socket: Socket service gpg-agent.service not loaded, refusing. Nov 16 17:48:27 node1 systemd[4772]: Failed to listen on GnuPG cryptographic agent and passphrase cache. Nov 16 17:48:27 node1 systemd[4772]: gpg-agent-ssh.socket: Socket service gpg-agent.service not loaded, refusing. Nov 16 17:48:27 node1 systemd[4772]: Failed to listen on GnuPG cryptographic agent (ssh-agent emulation). Nov 16 17:48:27 node1 systemd[4772]: Reached target Sockets. Nov 16 17:48:27 node1 systemd[4772]: Reached target Basic System. Nov 16 17:48:27 node1 systemd[1]: Started User Manager for UID 1006. Nov 16 17:48:27 node1 systemd[4772]: Reached target Default. Nov 16 17:48:27 node1 systemd[4772]: Startup finished in 27ms. Nov 16 17:48:27 node1 systemd[1]: Stopping User Manager for UID 1006... Nov 16 17:48:27 node1 systemd[4772]: Failed to enqueue exit.target job: Access denied Nov 16 17:48:32 node1 systemd[1]: user@1006.service: State 'stop-sigterm' timed out. Killing. Nov 16 17:48:32 node1 systemd[1]: user@1006.service: Killing process 4772 (systemd) with signal SIGKILL. Nov 16 17:48:32 node1 systemd[1]: user@1006.service: Failed with result 'timeout'. Nov 16 17:48:32 node1 systemd[1]: Stopped User Manager for UID 1006. Nov 16 17:48:32 node1 systemd[1]: Removed slice User Slice of hostedUser.