Nov 12 17:40:10.309877 kernel: Booting Linux on physical CPU 0x0000000000 [0x410fd083] Nov 12 17:40:10.309927 kernel: Linux version 6.6.60-flatcar (build@pony-truck.infra.kinvolk.io) (aarch64-cros-linux-gnu-gcc (Gentoo Hardened 13.3.1_p20240614 p17) 13.3.1 20240614, GNU ld (Gentoo 2.42 p3) 2.42.0) #1 SMP PREEMPT Tue Nov 12 16:24:35 -00 2024 Nov 12 17:40:10.309953 kernel: KASLR disabled due to lack of seed Nov 12 17:40:10.309970 kernel: efi: EFI v2.7 by EDK II Nov 12 17:40:10.309986 kernel: efi: SMBIOS=0x7bed0000 SMBIOS 3.0=0x7beb0000 ACPI=0x786e0000 ACPI 2.0=0x786e0014 MEMATTR=0x7b003a98 MEMRESERVE=0x7852ee18 Nov 12 17:40:10.310002 kernel: ACPI: Early table checksum verification disabled Nov 12 17:40:10.310020 kernel: ACPI: RSDP 0x00000000786E0014 000024 (v02 AMAZON) Nov 12 17:40:10.310036 kernel: ACPI: XSDT 0x00000000786D00E8 000064 (v01 AMAZON AMZNFACP 00000001 01000013) Nov 12 17:40:10.310052 kernel: ACPI: FACP 0x00000000786B0000 000114 (v06 AMAZON AMZNFACP 00000001 AMZN 00000001) Nov 12 17:40:10.310092 kernel: ACPI: DSDT 0x0000000078640000 00159D (v02 AMAZON AMZNDSDT 00000001 INTL 20160527) Nov 12 17:40:10.310117 kernel: ACPI: APIC 0x00000000786C0000 000108 (v04 AMAZON AMZNAPIC 00000001 AMZN 00000001) Nov 12 17:40:10.310134 kernel: ACPI: SPCR 0x00000000786A0000 000050 (v02 AMAZON AMZNSPCR 00000001 AMZN 00000001) Nov 12 17:40:10.312231 kernel: ACPI: GTDT 0x0000000078690000 000060 (v02 AMAZON AMZNGTDT 00000001 AMZN 00000001) Nov 12 17:40:10.312263 kernel: ACPI: MCFG 0x0000000078680000 00003C (v02 AMAZON AMZNMCFG 00000001 AMZN 00000001) Nov 12 17:40:10.312284 kernel: ACPI: SLIT 0x0000000078670000 00002D (v01 AMAZON AMZNSLIT 00000001 AMZN 00000001) Nov 12 17:40:10.312311 kernel: ACPI: IORT 0x0000000078660000 000078 (v01 AMAZON AMZNIORT 00000001 AMZN 00000001) Nov 12 17:40:10.312330 kernel: ACPI: PPTT 0x0000000078650000 0000EC (v01 AMAZON AMZNPPTT 00000001 AMZN 00000001) Nov 12 17:40:10.312347 kernel: ACPI: SPCR: console: uart,mmio,0x90a0000,115200 Nov 12 17:40:10.312366 kernel: earlycon: uart0 at MMIO 0x00000000090a0000 (options '115200') Nov 12 17:40:10.312383 kernel: printk: bootconsole [uart0] enabled Nov 12 17:40:10.312400 kernel: NUMA: Failed to initialise from firmware Nov 12 17:40:10.312418 kernel: NUMA: Faking a node at [mem 0x0000000040000000-0x00000004b5ffffff] Nov 12 17:40:10.312435 kernel: NUMA: NODE_DATA [mem 0x4b583f800-0x4b5844fff] Nov 12 17:40:10.312452 kernel: Zone ranges: Nov 12 17:40:10.312470 kernel: DMA [mem 0x0000000040000000-0x00000000ffffffff] Nov 12 17:40:10.312488 kernel: DMA32 empty Nov 12 17:40:10.312510 kernel: Normal [mem 0x0000000100000000-0x00000004b5ffffff] Nov 12 17:40:10.312528 kernel: Movable zone start for each node Nov 12 17:40:10.312544 kernel: Early memory node ranges Nov 12 17:40:10.312561 kernel: node 0: [mem 0x0000000040000000-0x000000007862ffff] Nov 12 17:40:10.312578 kernel: node 0: [mem 0x0000000078630000-0x000000007863ffff] Nov 12 17:40:10.312595 kernel: node 0: [mem 0x0000000078640000-0x00000000786effff] Nov 12 17:40:10.312611 kernel: node 0: [mem 0x00000000786f0000-0x000000007872ffff] Nov 12 17:40:10.312628 kernel: node 0: [mem 0x0000000078730000-0x000000007bbfffff] Nov 12 17:40:10.312645 kernel: node 0: [mem 0x000000007bc00000-0x000000007bfdffff] Nov 12 17:40:10.312662 kernel: node 0: [mem 0x000000007bfe0000-0x000000007fffffff] Nov 12 17:40:10.312679 kernel: node 0: [mem 0x0000000400000000-0x00000004b5ffffff] Nov 12 17:40:10.312696 kernel: Initmem setup node 0 [mem 0x0000000040000000-0x00000004b5ffffff] Nov 12 17:40:10.312717 kernel: On node 0, zone Normal: 8192 pages in unavailable ranges Nov 12 17:40:10.312735 kernel: psci: probing for conduit method from ACPI. Nov 12 17:40:10.312758 kernel: psci: PSCIv1.0 detected in firmware. Nov 12 17:40:10.312777 kernel: psci: Using standard PSCI v0.2 function IDs Nov 12 17:40:10.312795 kernel: psci: Trusted OS migration not required Nov 12 17:40:10.312817 kernel: psci: SMC Calling Convention v1.1 Nov 12 17:40:10.312836 kernel: percpu: Embedded 31 pages/cpu s86696 r8192 d32088 u126976 Nov 12 17:40:10.312854 kernel: pcpu-alloc: s86696 r8192 d32088 u126976 alloc=31*4096 Nov 12 17:40:10.312873 kernel: pcpu-alloc: [0] 0 [0] 1 Nov 12 17:40:10.312892 kernel: Detected PIPT I-cache on CPU0 Nov 12 17:40:10.312911 kernel: CPU features: detected: GIC system register CPU interface Nov 12 17:40:10.312929 kernel: CPU features: detected: Spectre-v2 Nov 12 17:40:10.312948 kernel: CPU features: detected: Spectre-v3a Nov 12 17:40:10.312967 kernel: CPU features: detected: Spectre-BHB Nov 12 17:40:10.312986 kernel: CPU features: detected: ARM erratum 1742098 Nov 12 17:40:10.313005 kernel: CPU features: detected: ARM errata 1165522, 1319367, or 1530923 Nov 12 17:40:10.313031 kernel: alternatives: applying boot alternatives Nov 12 17:40:10.313053 kernel: Kernel command line: BOOT_IMAGE=/flatcar/vmlinuz-a mount.usr=/dev/mapper/usr verity.usr=PARTUUID=7130c94a-213a-4e5a-8e26-6cce9662f132 rootflags=rw mount.usrflags=ro consoleblank=0 root=LABEL=ROOT console=tty1 console=ttyS0,115200n8 earlycon flatcar.first_boot=detected acpi=force flatcar.oem.id=ec2 modprobe.blacklist=xen_fbfront net.ifnames=0 nvme_core.io_timeout=4294967295 verity.usrhash=8c276c03cfeb31103ba0b5f1af613bdc698463ad3d29e6750e34154929bf187e Nov 12 17:40:10.313073 kernel: Unknown kernel command line parameters "BOOT_IMAGE=/flatcar/vmlinuz-a", will be passed to user space. Nov 12 17:40:10.313092 kernel: Dentry cache hash table entries: 524288 (order: 10, 4194304 bytes, linear) Nov 12 17:40:10.313111 kernel: Inode-cache hash table entries: 262144 (order: 9, 2097152 bytes, linear) Nov 12 17:40:10.313130 kernel: Fallback order for Node 0: 0 Nov 12 17:40:10.314888 kernel: Built 1 zonelists, mobility grouping on. Total pages: 991872 Nov 12 17:40:10.314916 kernel: Policy zone: Normal Nov 12 17:40:10.314935 kernel: mem auto-init: stack:off, heap alloc:off, heap free:off Nov 12 17:40:10.314954 kernel: software IO TLB: area num 2. Nov 12 17:40:10.314974 kernel: software IO TLB: mapped [mem 0x000000007c000000-0x0000000080000000] (64MB) Nov 12 17:40:10.315011 kernel: Memory: 3820216K/4030464K available (10240K kernel code, 2184K rwdata, 8096K rodata, 39360K init, 897K bss, 210248K reserved, 0K cma-reserved) Nov 12 17:40:10.315033 kernel: SLUB: HWalign=64, Order=0-3, MinObjects=0, CPUs=2, Nodes=1 Nov 12 17:40:10.315052 kernel: trace event string verifier disabled Nov 12 17:40:10.315071 kernel: rcu: Preemptible hierarchical RCU implementation. Nov 12 17:40:10.315091 kernel: rcu: RCU event tracing is enabled. Nov 12 17:40:10.315110 kernel: rcu: RCU restricting CPUs from NR_CPUS=512 to nr_cpu_ids=2. Nov 12 17:40:10.315129 kernel: Trampoline variant of Tasks RCU enabled. Nov 12 17:40:10.315181 kernel: Tracing variant of Tasks RCU enabled. Nov 12 17:40:10.315203 kernel: rcu: RCU calculated value of scheduler-enlistment delay is 100 jiffies. Nov 12 17:40:10.315222 kernel: rcu: Adjusting geometry for rcu_fanout_leaf=16, nr_cpu_ids=2 Nov 12 17:40:10.315241 kernel: NR_IRQS: 64, nr_irqs: 64, preallocated irqs: 0 Nov 12 17:40:10.315272 kernel: GICv3: 96 SPIs implemented Nov 12 17:40:10.315291 kernel: GICv3: 0 Extended SPIs implemented Nov 12 17:40:10.315309 kernel: Root IRQ handler: gic_handle_irq Nov 12 17:40:10.315327 kernel: GICv3: GICv3 features: 16 PPIs Nov 12 17:40:10.315345 kernel: GICv3: CPU0: found redistributor 0 region 0:0x0000000010200000 Nov 12 17:40:10.315363 kernel: ITS [mem 0x10080000-0x1009ffff] Nov 12 17:40:10.315380 kernel: ITS@0x0000000010080000: allocated 8192 Devices @4000b0000 (indirect, esz 8, psz 64K, shr 1) Nov 12 17:40:10.315398 kernel: ITS@0x0000000010080000: allocated 8192 Interrupt Collections @4000c0000 (flat, esz 8, psz 64K, shr 1) Nov 12 17:40:10.315416 kernel: GICv3: using LPI property table @0x00000004000d0000 Nov 12 17:40:10.315434 kernel: ITS: Using hypervisor restricted LPI range [128] Nov 12 17:40:10.315452 kernel: GICv3: CPU0: using allocated LPI pending table @0x00000004000e0000 Nov 12 17:40:10.315471 kernel: rcu: srcu_init: Setting srcu_struct sizes based on contention. Nov 12 17:40:10.315494 kernel: arch_timer: cp15 timer(s) running at 83.33MHz (virt). Nov 12 17:40:10.315512 kernel: clocksource: arch_sys_counter: mask: 0x1ffffffffffffff max_cycles: 0x13381ebeec, max_idle_ns: 440795203145 ns Nov 12 17:40:10.315530 kernel: sched_clock: 57 bits at 83MHz, resolution 12ns, wraps every 4398046511100ns Nov 12 17:40:10.315548 kernel: Console: colour dummy device 80x25 Nov 12 17:40:10.315566 kernel: printk: console [tty1] enabled Nov 12 17:40:10.315585 kernel: ACPI: Core revision 20230628 Nov 12 17:40:10.315604 kernel: Calibrating delay loop (skipped), value calculated using timer frequency.. 166.66 BogoMIPS (lpj=83333) Nov 12 17:40:10.315622 kernel: pid_max: default: 32768 minimum: 301 Nov 12 17:40:10.315640 kernel: LSM: initializing lsm=lockdown,capability,landlock,selinux,integrity Nov 12 17:40:10.315664 kernel: landlock: Up and running. Nov 12 17:40:10.315683 kernel: SELinux: Initializing. Nov 12 17:40:10.315701 kernel: Mount-cache hash table entries: 8192 (order: 4, 65536 bytes, linear) Nov 12 17:40:10.315720 kernel: Mountpoint-cache hash table entries: 8192 (order: 4, 65536 bytes, linear) Nov 12 17:40:10.315739 kernel: RCU Tasks: Setting shift to 1 and lim to 1 rcu_task_cb_adjust=1 rcu_task_cpu_ids=2. Nov 12 17:40:10.315757 kernel: RCU Tasks Trace: Setting shift to 1 and lim to 1 rcu_task_cb_adjust=1 rcu_task_cpu_ids=2. Nov 12 17:40:10.315775 kernel: rcu: Hierarchical SRCU implementation. Nov 12 17:40:10.315794 kernel: rcu: Max phase no-delay instances is 400. Nov 12 17:40:10.315812 kernel: Platform MSI: ITS@0x10080000 domain created Nov 12 17:40:10.315835 kernel: PCI/MSI: ITS@0x10080000 domain created Nov 12 17:40:10.315853 kernel: Remapping and enabling EFI services. Nov 12 17:40:10.315871 kernel: smp: Bringing up secondary CPUs ... Nov 12 17:40:10.315889 kernel: Detected PIPT I-cache on CPU1 Nov 12 17:40:10.315907 kernel: GICv3: CPU1: found redistributor 1 region 0:0x0000000010220000 Nov 12 17:40:10.315925 kernel: GICv3: CPU1: using allocated LPI pending table @0x00000004000f0000 Nov 12 17:40:10.315944 kernel: CPU1: Booted secondary processor 0x0000000001 [0x410fd083] Nov 12 17:40:10.315962 kernel: smp: Brought up 1 node, 2 CPUs Nov 12 17:40:10.315980 kernel: SMP: Total of 2 processors activated. Nov 12 17:40:10.316003 kernel: CPU features: detected: 32-bit EL0 Support Nov 12 17:40:10.316021 kernel: CPU features: detected: 32-bit EL1 Support Nov 12 17:40:10.316040 kernel: CPU features: detected: CRC32 instructions Nov 12 17:40:10.316069 kernel: CPU: All CPU(s) started at EL1 Nov 12 17:40:10.316092 kernel: alternatives: applying system-wide alternatives Nov 12 17:40:10.316111 kernel: devtmpfs: initialized Nov 12 17:40:10.316131 kernel: clocksource: jiffies: mask: 0xffffffff max_cycles: 0xffffffff, max_idle_ns: 1911260446275000 ns Nov 12 17:40:10.318378 kernel: futex hash table entries: 512 (order: 3, 32768 bytes, linear) Nov 12 17:40:10.318401 kernel: pinctrl core: initialized pinctrl subsystem Nov 12 17:40:10.318422 kernel: SMBIOS 3.0.0 present. Nov 12 17:40:10.318455 kernel: DMI: Amazon EC2 a1.large/, BIOS 1.0 11/1/2018 Nov 12 17:40:10.318476 kernel: NET: Registered PF_NETLINK/PF_ROUTE protocol family Nov 12 17:40:10.318495 kernel: DMA: preallocated 512 KiB GFP_KERNEL pool for atomic allocations Nov 12 17:40:10.318515 kernel: DMA: preallocated 512 KiB GFP_KERNEL|GFP_DMA pool for atomic allocations Nov 12 17:40:10.318535 kernel: DMA: preallocated 512 KiB GFP_KERNEL|GFP_DMA32 pool for atomic allocations Nov 12 17:40:10.318555 kernel: audit: initializing netlink subsys (disabled) Nov 12 17:40:10.318574 kernel: audit: type=2000 audit(0.374:1): state=initialized audit_enabled=0 res=1 Nov 12 17:40:10.318599 kernel: thermal_sys: Registered thermal governor 'step_wise' Nov 12 17:40:10.318618 kernel: cpuidle: using governor menu Nov 12 17:40:10.318637 kernel: hw-breakpoint: found 6 breakpoint and 4 watchpoint registers. Nov 12 17:40:10.318656 kernel: ASID allocator initialised with 65536 entries Nov 12 17:40:10.318675 kernel: acpiphp: ACPI Hot Plug PCI Controller Driver version: 0.5 Nov 12 17:40:10.318694 kernel: Serial: AMBA PL011 UART driver Nov 12 17:40:10.318713 kernel: Modules: 17520 pages in range for non-PLT usage Nov 12 17:40:10.318732 kernel: Modules: 509040 pages in range for PLT usage Nov 12 17:40:10.318752 kernel: HugeTLB: registered 1.00 GiB page size, pre-allocated 0 pages Nov 12 17:40:10.318775 kernel: HugeTLB: 0 KiB vmemmap can be freed for a 1.00 GiB page Nov 12 17:40:10.318795 kernel: HugeTLB: registered 32.0 MiB page size, pre-allocated 0 pages Nov 12 17:40:10.318814 kernel: HugeTLB: 0 KiB vmemmap can be freed for a 32.0 MiB page Nov 12 17:40:10.318833 kernel: HugeTLB: registered 2.00 MiB page size, pre-allocated 0 pages Nov 12 17:40:10.318853 kernel: HugeTLB: 0 KiB vmemmap can be freed for a 2.00 MiB page Nov 12 17:40:10.318872 kernel: HugeTLB: registered 64.0 KiB page size, pre-allocated 0 pages Nov 12 17:40:10.318891 kernel: HugeTLB: 0 KiB vmemmap can be freed for a 64.0 KiB page Nov 12 17:40:10.318910 kernel: ACPI: Added _OSI(Module Device) Nov 12 17:40:10.318929 kernel: ACPI: Added _OSI(Processor Device) Nov 12 17:40:10.318953 kernel: ACPI: Added _OSI(3.0 _SCP Extensions) Nov 12 17:40:10.318972 kernel: ACPI: Added _OSI(Processor Aggregator Device) Nov 12 17:40:10.318991 kernel: ACPI: 1 ACPI AML tables successfully acquired and loaded Nov 12 17:40:10.319010 kernel: ACPI: Interpreter enabled Nov 12 17:40:10.319030 kernel: ACPI: Using GIC for interrupt routing Nov 12 17:40:10.319049 kernel: ACPI: MCFG table detected, 1 entries Nov 12 17:40:10.319068 kernel: ACPI: PCI Root Bridge [PCI0] (domain 0000 [bus 00-0f]) Nov 12 17:40:10.322657 kernel: acpi PNP0A08:00: _OSC: OS supports [ExtendedConfig ASPM ClockPM Segments MSI HPX-Type3] Nov 12 17:40:10.322912 kernel: acpi PNP0A08:00: _OSC: platform does not support [LTR] Nov 12 17:40:10.323131 kernel: acpi PNP0A08:00: _OSC: OS now controls [PCIeHotplug PME AER PCIeCapability] Nov 12 17:40:10.323384 kernel: acpi PNP0A08:00: ECAM area [mem 0x20000000-0x20ffffff] reserved by PNP0C02:00 Nov 12 17:40:10.323600 kernel: acpi PNP0A08:00: ECAM at [mem 0x20000000-0x20ffffff] for [bus 00-0f] Nov 12 17:40:10.323627 kernel: ACPI: Remapped I/O 0x000000001fff0000 to [io 0x0000-0xffff window] Nov 12 17:40:10.323648 kernel: acpiphp: Slot [1] registered Nov 12 17:40:10.323667 kernel: acpiphp: Slot [2] registered Nov 12 17:40:10.323687 kernel: acpiphp: Slot [3] registered Nov 12 17:40:10.323713 kernel: acpiphp: Slot [4] registered Nov 12 17:40:10.323733 kernel: acpiphp: Slot [5] registered Nov 12 17:40:10.323752 kernel: acpiphp: Slot [6] registered Nov 12 17:40:10.323770 kernel: acpiphp: Slot [7] registered Nov 12 17:40:10.323789 kernel: acpiphp: Slot [8] registered Nov 12 17:40:10.323808 kernel: acpiphp: Slot [9] registered Nov 12 17:40:10.323827 kernel: acpiphp: Slot [10] registered Nov 12 17:40:10.323846 kernel: acpiphp: Slot [11] registered Nov 12 17:40:10.323864 kernel: acpiphp: Slot [12] registered Nov 12 17:40:10.323883 kernel: acpiphp: Slot [13] registered Nov 12 17:40:10.323906 kernel: acpiphp: Slot [14] registered Nov 12 17:40:10.323925 kernel: acpiphp: Slot [15] registered Nov 12 17:40:10.323944 kernel: acpiphp: Slot [16] registered Nov 12 17:40:10.323962 kernel: acpiphp: Slot [17] registered Nov 12 17:40:10.323982 kernel: acpiphp: Slot [18] registered Nov 12 17:40:10.324001 kernel: acpiphp: Slot [19] registered Nov 12 17:40:10.324020 kernel: acpiphp: Slot [20] registered Nov 12 17:40:10.324038 kernel: acpiphp: Slot [21] registered Nov 12 17:40:10.324057 kernel: acpiphp: Slot [22] registered Nov 12 17:40:10.324080 kernel: acpiphp: Slot [23] registered Nov 12 17:40:10.324099 kernel: acpiphp: Slot [24] registered Nov 12 17:40:10.324118 kernel: acpiphp: Slot [25] registered Nov 12 17:40:10.326014 kernel: acpiphp: Slot [26] registered Nov 12 17:40:10.326080 kernel: acpiphp: Slot [27] registered Nov 12 17:40:10.326106 kernel: acpiphp: Slot [28] registered Nov 12 17:40:10.326126 kernel: acpiphp: Slot [29] registered Nov 12 17:40:10.326473 kernel: acpiphp: Slot [30] registered Nov 12 17:40:10.326500 kernel: acpiphp: Slot [31] registered Nov 12 17:40:10.326519 kernel: PCI host bridge to bus 0000:00 Nov 12 17:40:10.326802 kernel: pci_bus 0000:00: root bus resource [mem 0x80000000-0xffffffff window] Nov 12 17:40:10.327000 kernel: pci_bus 0000:00: root bus resource [io 0x0000-0xffff window] Nov 12 17:40:10.327767 kernel: pci_bus 0000:00: root bus resource [mem 0x400000000000-0x407fffffffff window] Nov 12 17:40:10.327992 kernel: pci_bus 0000:00: root bus resource [bus 00-0f] Nov 12 17:40:10.330121 kernel: pci 0000:00:00.0: [1d0f:0200] type 00 class 0x060000 Nov 12 17:40:10.331757 kernel: pci 0000:00:01.0: [1d0f:8250] type 00 class 0x070003 Nov 12 17:40:10.332017 kernel: pci 0000:00:01.0: reg 0x10: [mem 0x80118000-0x80118fff] Nov 12 17:40:10.332610 kernel: pci 0000:00:04.0: [1d0f:8061] type 00 class 0x010802 Nov 12 17:40:10.332879 kernel: pci 0000:00:04.0: reg 0x10: [mem 0x80114000-0x80117fff] Nov 12 17:40:10.333128 kernel: pci 0000:00:04.0: PME# supported from D0 D1 D2 D3hot D3cold Nov 12 17:40:10.335383 kernel: pci 0000:00:05.0: [1d0f:ec20] type 00 class 0x020000 Nov 12 17:40:10.335667 kernel: pci 0000:00:05.0: reg 0x10: [mem 0x80110000-0x80113fff] Nov 12 17:40:10.335929 kernel: pci 0000:00:05.0: reg 0x18: [mem 0x80000000-0x800fffff pref] Nov 12 17:40:10.338429 kernel: pci 0000:00:05.0: reg 0x20: [mem 0x80100000-0x8010ffff] Nov 12 17:40:10.338698 kernel: pci 0000:00:05.0: PME# supported from D0 D1 D2 D3hot D3cold Nov 12 17:40:10.338911 kernel: pci 0000:00:05.0: BAR 2: assigned [mem 0x80000000-0x800fffff pref] Nov 12 17:40:10.340801 kernel: pci 0000:00:05.0: BAR 4: assigned [mem 0x80100000-0x8010ffff] Nov 12 17:40:10.341030 kernel: pci 0000:00:04.0: BAR 0: assigned [mem 0x80110000-0x80113fff] Nov 12 17:40:10.341324 kernel: pci 0000:00:05.0: BAR 0: assigned [mem 0x80114000-0x80117fff] Nov 12 17:40:10.341549 kernel: pci 0000:00:01.0: BAR 0: assigned [mem 0x80118000-0x80118fff] Nov 12 17:40:10.341756 kernel: pci_bus 0000:00: resource 4 [mem 0x80000000-0xffffffff window] Nov 12 17:40:10.341941 kernel: pci_bus 0000:00: resource 5 [io 0x0000-0xffff window] Nov 12 17:40:10.342239 kernel: pci_bus 0000:00: resource 6 [mem 0x400000000000-0x407fffffffff window] Nov 12 17:40:10.342269 kernel: ACPI: PCI: Interrupt link GSI0 configured for IRQ 35 Nov 12 17:40:10.342290 kernel: ACPI: PCI: Interrupt link GSI1 configured for IRQ 36 Nov 12 17:40:10.342312 kernel: ACPI: PCI: Interrupt link GSI2 configured for IRQ 37 Nov 12 17:40:10.342332 kernel: ACPI: PCI: Interrupt link GSI3 configured for IRQ 38 Nov 12 17:40:10.342351 kernel: iommu: Default domain type: Translated Nov 12 17:40:10.342377 kernel: iommu: DMA domain TLB invalidation policy: strict mode Nov 12 17:40:10.342396 kernel: efivars: Registered efivars operations Nov 12 17:40:10.342415 kernel: vgaarb: loaded Nov 12 17:40:10.342433 kernel: clocksource: Switched to clocksource arch_sys_counter Nov 12 17:40:10.342452 kernel: VFS: Disk quotas dquot_6.6.0 Nov 12 17:40:10.342470 kernel: VFS: Dquot-cache hash table entries: 512 (order 0, 4096 bytes) Nov 12 17:40:10.342489 kernel: pnp: PnP ACPI init Nov 12 17:40:10.342707 kernel: system 00:00: [mem 0x20000000-0x2fffffff] could not be reserved Nov 12 17:40:10.342741 kernel: pnp: PnP ACPI: found 1 devices Nov 12 17:40:10.342761 kernel: NET: Registered PF_INET protocol family Nov 12 17:40:10.342780 kernel: IP idents hash table entries: 65536 (order: 7, 524288 bytes, linear) Nov 12 17:40:10.342800 kernel: tcp_listen_portaddr_hash hash table entries: 2048 (order: 3, 32768 bytes, linear) Nov 12 17:40:10.342819 kernel: Table-perturb hash table entries: 65536 (order: 6, 262144 bytes, linear) Nov 12 17:40:10.342839 kernel: TCP established hash table entries: 32768 (order: 6, 262144 bytes, linear) Nov 12 17:40:10.342858 kernel: TCP bind hash table entries: 32768 (order: 8, 1048576 bytes, linear) Nov 12 17:40:10.342877 kernel: TCP: Hash tables configured (established 32768 bind 32768) Nov 12 17:40:10.342896 kernel: UDP hash table entries: 2048 (order: 4, 65536 bytes, linear) Nov 12 17:40:10.342919 kernel: UDP-Lite hash table entries: 2048 (order: 4, 65536 bytes, linear) Nov 12 17:40:10.342938 kernel: NET: Registered PF_UNIX/PF_LOCAL protocol family Nov 12 17:40:10.342957 kernel: PCI: CLS 0 bytes, default 64 Nov 12 17:40:10.342976 kernel: kvm [1]: HYP mode not available Nov 12 17:40:10.342995 kernel: Initialise system trusted keyrings Nov 12 17:40:10.343014 kernel: workingset: timestamp_bits=39 max_order=20 bucket_order=0 Nov 12 17:40:10.343033 kernel: Key type asymmetric registered Nov 12 17:40:10.343052 kernel: Asymmetric key parser 'x509' registered Nov 12 17:40:10.343071 kernel: Block layer SCSI generic (bsg) driver version 0.4 loaded (major 250) Nov 12 17:40:10.343094 kernel: io scheduler mq-deadline registered Nov 12 17:40:10.343113 kernel: io scheduler kyber registered Nov 12 17:40:10.343132 kernel: io scheduler bfq registered Nov 12 17:40:10.343404 kernel: pl061_gpio ARMH0061:00: PL061 GPIO chip registered Nov 12 17:40:10.343439 kernel: input: Power Button as /devices/LNXSYSTM:00/LNXSYBUS:00/PNP0C0C:00/input/input0 Nov 12 17:40:10.343462 kernel: ACPI: button: Power Button [PWRB] Nov 12 17:40:10.343483 kernel: input: Sleep Button as /devices/LNXSYSTM:00/LNXSYBUS:00/PNP0C0E:00/input/input1 Nov 12 17:40:10.343502 kernel: ACPI: button: Sleep Button [SLPB] Nov 12 17:40:10.343527 kernel: Serial: 8250/16550 driver, 4 ports, IRQ sharing enabled Nov 12 17:40:10.343547 kernel: ACPI: \_SB_.PCI0.GSI2: Enabled at IRQ 37 Nov 12 17:40:10.343825 kernel: serial 0000:00:01.0: enabling device (0010 -> 0012) Nov 12 17:40:10.343855 kernel: printk: console [ttyS0] disabled Nov 12 17:40:10.343876 kernel: 0000:00:01.0: ttyS0 at MMIO 0x80118000 (irq = 14, base_baud = 115200) is a 16550A Nov 12 17:40:10.343973 kernel: printk: console [ttyS0] enabled Nov 12 17:40:10.344584 kernel: printk: bootconsole [uart0] disabled Nov 12 17:40:10.344904 kernel: thunder_xcv, ver 1.0 Nov 12 17:40:10.345376 kernel: thunder_bgx, ver 1.0 Nov 12 17:40:10.345406 kernel: nicpf, ver 1.0 Nov 12 17:40:10.345425 kernel: nicvf, ver 1.0 Nov 12 17:40:10.345654 kernel: rtc-efi rtc-efi.0: registered as rtc0 Nov 12 17:40:10.345850 kernel: rtc-efi rtc-efi.0: setting system clock to 2024-11-12T17:40:09 UTC (1731433209) Nov 12 17:40:10.345876 kernel: hid: raw HID events driver (C) Jiri Kosina Nov 12 17:40:10.345896 kernel: hw perfevents: enabled with armv8_pmuv3_0 PMU driver, 3 counters available Nov 12 17:40:10.345915 kernel: watchdog: Delayed init of the lockup detector failed: -19 Nov 12 17:40:10.345934 kernel: watchdog: Hard watchdog permanently disabled Nov 12 17:40:10.345958 kernel: NET: Registered PF_INET6 protocol family Nov 12 17:40:10.345977 kernel: Segment Routing with IPv6 Nov 12 17:40:10.345996 kernel: In-situ OAM (IOAM) with IPv6 Nov 12 17:40:10.346014 kernel: NET: Registered PF_PACKET protocol family Nov 12 17:40:10.346033 kernel: Key type dns_resolver registered Nov 12 17:40:10.346052 kernel: registered taskstats version 1 Nov 12 17:40:10.346111 kernel: Loading compiled-in X.509 certificates Nov 12 17:40:10.346167 kernel: Loaded X.509 cert 'Kinvolk GmbH: Module signing key for 6.6.60-flatcar: 277bea35d8d47c9841f307ab609d4271c3622dcb' Nov 12 17:40:10.346189 kernel: Key type .fscrypt registered Nov 12 17:40:10.346216 kernel: Key type fscrypt-provisioning registered Nov 12 17:40:10.346235 kernel: ima: No TPM chip found, activating TPM-bypass! Nov 12 17:40:10.346279 kernel: ima: Allocated hash algorithm: sha1 Nov 12 17:40:10.346299 kernel: ima: No architecture policies found Nov 12 17:40:10.346318 kernel: alg: No test for fips(ansi_cprng) (fips_ansi_cprng) Nov 12 17:40:10.346338 kernel: clk: Disabling unused clocks Nov 12 17:40:10.346357 kernel: Freeing unused kernel memory: 39360K Nov 12 17:40:10.346376 kernel: Run /init as init process Nov 12 17:40:10.346395 kernel: with arguments: Nov 12 17:40:10.346414 kernel: /init Nov 12 17:40:10.346439 kernel: with environment: Nov 12 17:40:10.346458 kernel: HOME=/ Nov 12 17:40:10.346477 kernel: TERM=linux Nov 12 17:40:10.346495 kernel: BOOT_IMAGE=/flatcar/vmlinuz-a Nov 12 17:40:10.346519 systemd[1]: systemd 255 running in system mode (+PAM +AUDIT +SELINUX -APPARMOR +IMA +SMACK +SECCOMP +GCRYPT -GNUTLS +OPENSSL -ACL +BLKID +CURL +ELFUTILS -FIDO2 +IDN2 -IDN +IPTC +KMOD +LIBCRYPTSETUP +LIBFDISK +PCRE2 -PWQUALITY -P11KIT -QRENCODE +TPM2 +BZIP2 +LZ4 +XZ +ZLIB +ZSTD -BPF_FRAMEWORK -XKBCOMMON +UTMP -SYSVINIT default-hierarchy=unified) Nov 12 17:40:10.346542 systemd[1]: Detected virtualization amazon. Nov 12 17:40:10.346564 systemd[1]: Detected architecture arm64. Nov 12 17:40:10.346588 systemd[1]: Running in initrd. Nov 12 17:40:10.346609 systemd[1]: No hostname configured, using default hostname. Nov 12 17:40:10.346629 systemd[1]: Hostname set to . Nov 12 17:40:10.346651 systemd[1]: Initializing machine ID from VM UUID. Nov 12 17:40:10.346671 systemd[1]: Queued start job for default target initrd.target. Nov 12 17:40:10.346692 systemd[1]: Started clevis-luks-askpass.path - Forward Password Requests to Clevis Directory Watch. Nov 12 17:40:10.346713 systemd[1]: Started systemd-ask-password-console.path - Dispatch Password Requests to Console Directory Watch. Nov 12 17:40:10.346734 systemd[1]: Expecting device dev-disk-by\x2dlabel-EFI\x2dSYSTEM.device - /dev/disk/by-label/EFI-SYSTEM... Nov 12 17:40:10.346760 systemd[1]: Expecting device dev-disk-by\x2dlabel-OEM.device - /dev/disk/by-label/OEM... Nov 12 17:40:10.346781 systemd[1]: Expecting device dev-disk-by\x2dlabel-ROOT.device - /dev/disk/by-label/ROOT... Nov 12 17:40:10.346802 systemd[1]: Expecting device dev-disk-by\x2dpartlabel-USR\x2dA.device - /dev/disk/by-partlabel/USR-A... Nov 12 17:40:10.346826 systemd[1]: Expecting device dev-disk-by\x2dpartuuid-7130c94a\x2d213a\x2d4e5a\x2d8e26\x2d6cce9662f132.device - /dev/disk/by-partuuid/7130c94a-213a-4e5a-8e26-6cce9662f132... Nov 12 17:40:10.346847 systemd[1]: Expecting device dev-mapper-usr.device - /dev/mapper/usr... Nov 12 17:40:10.346868 systemd[1]: Reached target cryptsetup-pre.target - Local Encrypted Volumes (Pre). Nov 12 17:40:10.346889 systemd[1]: Reached target cryptsetup.target - Local Encrypted Volumes. Nov 12 17:40:10.346915 systemd[1]: Reached target paths.target - Path Units. Nov 12 17:40:10.346935 systemd[1]: Reached target slices.target - Slice Units. Nov 12 17:40:10.346956 systemd[1]: Reached target swap.target - Swaps. Nov 12 17:40:10.346977 systemd[1]: Reached target timers.target - Timer Units. Nov 12 17:40:10.346998 systemd[1]: Listening on iscsid.socket - Open-iSCSI iscsid Socket. Nov 12 17:40:10.347019 systemd[1]: Listening on iscsiuio.socket - Open-iSCSI iscsiuio Socket. Nov 12 17:40:10.347040 systemd[1]: Listening on systemd-journald-dev-log.socket - Journal Socket (/dev/log). Nov 12 17:40:10.347061 systemd[1]: Listening on systemd-journald.socket - Journal Socket. Nov 12 17:40:10.347082 systemd[1]: Listening on systemd-networkd.socket - Network Service Netlink Socket. Nov 12 17:40:10.347107 systemd[1]: Listening on systemd-udevd-control.socket - udev Control Socket. Nov 12 17:40:10.347128 systemd[1]: Listening on systemd-udevd-kernel.socket - udev Kernel Socket. Nov 12 17:40:10.347254 systemd[1]: Reached target sockets.target - Socket Units. Nov 12 17:40:10.347279 systemd[1]: Starting ignition-setup-pre.service - Ignition env setup... Nov 12 17:40:10.347301 systemd[1]: Starting kmod-static-nodes.service - Create List of Static Device Nodes... Nov 12 17:40:10.347323 systemd[1]: Finished network-cleanup.service - Network Cleanup. Nov 12 17:40:10.347344 systemd[1]: Starting systemd-fsck-usr.service... Nov 12 17:40:10.347365 systemd[1]: Starting systemd-journald.service - Journal Service... Nov 12 17:40:10.347394 systemd[1]: Starting systemd-modules-load.service - Load Kernel Modules... Nov 12 17:40:10.347415 systemd[1]: Starting systemd-vconsole-setup.service - Virtual Console Setup... Nov 12 17:40:10.347436 systemd[1]: Finished ignition-setup-pre.service - Ignition env setup. Nov 12 17:40:10.347458 systemd[1]: Finished kmod-static-nodes.service - Create List of Static Device Nodes. Nov 12 17:40:10.347479 systemd[1]: Finished systemd-fsck-usr.service. Nov 12 17:40:10.347543 systemd-journald[250]: Collecting audit messages is disabled. Nov 12 17:40:10.347593 systemd[1]: Starting systemd-tmpfiles-setup-dev-early.service - Create Static Device Nodes in /dev gracefully... Nov 12 17:40:10.347615 kernel: bridge: filtering via arp/ip/ip6tables is no longer available by default. Update your scripts to load br_netfilter if you need this. Nov 12 17:40:10.347638 kernel: Bridge firewalling registered Nov 12 17:40:10.347658 systemd[1]: Finished systemd-modules-load.service - Load Kernel Modules. Nov 12 17:40:10.347679 systemd[1]: Finished systemd-vconsole-setup.service - Virtual Console Setup. Nov 12 17:40:10.347700 systemd[1]: Finished systemd-tmpfiles-setup-dev-early.service - Create Static Device Nodes in /dev gracefully. Nov 12 17:40:10.347721 systemd-journald[250]: Journal started Nov 12 17:40:10.347759 systemd-journald[250]: Runtime Journal (/run/log/journal/ec22bb7fc9328957bc837c83e4fb4b62) is 8.0M, max 75.3M, 67.3M free. Nov 12 17:40:10.294052 systemd-modules-load[251]: Inserted module 'overlay' Nov 12 17:40:10.325116 systemd-modules-load[251]: Inserted module 'br_netfilter' Nov 12 17:40:10.364185 systemd[1]: Starting dracut-cmdline-ask.service - dracut ask for additional cmdline parameters... Nov 12 17:40:10.368317 systemd[1]: Starting systemd-sysctl.service - Apply Kernel Variables... Nov 12 17:40:10.376549 systemd[1]: Starting systemd-tmpfiles-setup-dev.service - Create Static Device Nodes in /dev... Nov 12 17:40:10.376615 systemd[1]: Started systemd-journald.service - Journal Service. Nov 12 17:40:10.396479 systemd[1]: Starting systemd-tmpfiles-setup.service - Create System Files and Directories... Nov 12 17:40:10.420117 systemd[1]: Finished systemd-sysctl.service - Apply Kernel Variables. Nov 12 17:40:10.427527 systemd[1]: Finished systemd-tmpfiles-setup-dev.service - Create Static Device Nodes in /dev. Nov 12 17:40:10.433354 systemd[1]: Finished dracut-cmdline-ask.service - dracut ask for additional cmdline parameters. Nov 12 17:40:10.456626 systemd[1]: Starting dracut-cmdline.service - dracut cmdline hook... Nov 12 17:40:10.464685 systemd[1]: Finished systemd-tmpfiles-setup.service - Create System Files and Directories. Nov 12 17:40:10.478025 systemd[1]: Starting systemd-resolved.service - Network Name Resolution... Nov 12 17:40:10.501294 dracut-cmdline[286]: dracut-dracut-053 Nov 12 17:40:10.508825 dracut-cmdline[286]: Using kernel command line parameters: rd.driver.pre=btrfs BOOT_IMAGE=/flatcar/vmlinuz-a mount.usr=/dev/mapper/usr verity.usr=PARTUUID=7130c94a-213a-4e5a-8e26-6cce9662f132 rootflags=rw mount.usrflags=ro consoleblank=0 root=LABEL=ROOT console=tty1 console=ttyS0,115200n8 earlycon flatcar.first_boot=detected acpi=force flatcar.oem.id=ec2 modprobe.blacklist=xen_fbfront net.ifnames=0 nvme_core.io_timeout=4294967295 verity.usrhash=8c276c03cfeb31103ba0b5f1af613bdc698463ad3d29e6750e34154929bf187e Nov 12 17:40:10.584678 systemd-resolved[291]: Positive Trust Anchors: Nov 12 17:40:10.584706 systemd-resolved[291]: . IN DS 20326 8 2 e06d44b80b8f1d39a95c0b0d7c65d08458e880409bbc683457104237c7f8ec8d Nov 12 17:40:10.584768 systemd-resolved[291]: Negative trust anchors: home.arpa 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 170.0.0.192.in-addr.arpa 171.0.0.192.in-addr.arpa 168.192.in-addr.arpa d.f.ip6.arpa ipv4only.arpa resolver.arpa corp home internal intranet lan local private test Nov 12 17:40:10.655192 kernel: SCSI subsystem initialized Nov 12 17:40:10.663189 kernel: Loading iSCSI transport class v2.0-870. Nov 12 17:40:10.677202 kernel: iscsi: registered transport (tcp) Nov 12 17:40:10.701703 kernel: iscsi: registered transport (qla4xxx) Nov 12 17:40:10.701789 kernel: QLogic iSCSI HBA Driver Nov 12 17:40:10.819214 kernel: random: crng init done Nov 12 17:40:10.819964 systemd-resolved[291]: Defaulting to hostname 'linux'. Nov 12 17:40:10.827059 systemd[1]: Started systemd-resolved.service - Network Name Resolution. Nov 12 17:40:10.832830 systemd[1]: Reached target nss-lookup.target - Host and Network Name Lookups. Nov 12 17:40:10.857245 systemd[1]: Finished dracut-cmdline.service - dracut cmdline hook. Nov 12 17:40:10.869634 systemd[1]: Starting dracut-pre-udev.service - dracut pre-udev hook... Nov 12 17:40:10.923218 kernel: device-mapper: core: CONFIG_IMA_DISABLE_HTABLE is disabled. Duplicate IMA measurements will not be recorded in the IMA log. Nov 12 17:40:10.923318 kernel: device-mapper: uevent: version 1.0.3 Nov 12 17:40:10.923348 kernel: device-mapper: ioctl: 4.48.0-ioctl (2023-03-01) initialised: dm-devel@redhat.com Nov 12 17:40:10.996237 kernel: raid6: neonx8 gen() 6607 MB/s Nov 12 17:40:11.013202 kernel: raid6: neonx4 gen() 6495 MB/s Nov 12 17:40:11.030202 kernel: raid6: neonx2 gen() 5441 MB/s Nov 12 17:40:11.047175 kernel: raid6: neonx1 gen() 3956 MB/s Nov 12 17:40:11.064212 kernel: raid6: int64x8 gen() 3804 MB/s Nov 12 17:40:11.081202 kernel: raid6: int64x4 gen() 3676 MB/s Nov 12 17:40:11.098243 kernel: raid6: int64x2 gen() 3566 MB/s Nov 12 17:40:11.116049 kernel: raid6: int64x1 gen() 2708 MB/s Nov 12 17:40:11.116210 kernel: raid6: using algorithm neonx8 gen() 6607 MB/s Nov 12 17:40:11.134057 kernel: raid6: .... xor() 4711 MB/s, rmw enabled Nov 12 17:40:11.134130 kernel: raid6: using neon recovery algorithm Nov 12 17:40:11.143677 kernel: xor: measuring software checksum speed Nov 12 17:40:11.143797 kernel: 8regs : 10902 MB/sec Nov 12 17:40:11.144808 kernel: 32regs : 11869 MB/sec Nov 12 17:40:11.145194 kernel: arm64_neon : 8679 MB/sec Nov 12 17:40:11.147051 kernel: xor: using function: 32regs (11869 MB/sec) Nov 12 17:40:11.240217 kernel: Btrfs loaded, zoned=no, fsverity=no Nov 12 17:40:11.267675 systemd[1]: Finished dracut-pre-udev.service - dracut pre-udev hook. Nov 12 17:40:11.291614 systemd[1]: Starting systemd-udevd.service - Rule-based Manager for Device Events and Files... Nov 12 17:40:11.345482 systemd-udevd[471]: Using default interface naming scheme 'v255'. Nov 12 17:40:11.357429 systemd[1]: Started systemd-udevd.service - Rule-based Manager for Device Events and Files. Nov 12 17:40:11.377995 systemd[1]: Starting dracut-pre-trigger.service - dracut pre-trigger hook... Nov 12 17:40:11.421587 dracut-pre-trigger[476]: rd.md=0: removing MD RAID activation Nov 12 17:40:11.501561 systemd[1]: Finished dracut-pre-trigger.service - dracut pre-trigger hook. Nov 12 17:40:11.513764 systemd[1]: Starting systemd-udev-trigger.service - Coldplug All udev Devices... Nov 12 17:40:11.664805 systemd[1]: Finished systemd-udev-trigger.service - Coldplug All udev Devices. Nov 12 17:40:11.680564 systemd[1]: Starting dracut-initqueue.service - dracut initqueue hook... Nov 12 17:40:11.745730 systemd[1]: Finished dracut-initqueue.service - dracut initqueue hook. Nov 12 17:40:11.751887 systemd[1]: Reached target remote-fs-pre.target - Preparation for Remote File Systems. Nov 12 17:40:11.754441 systemd[1]: Reached target remote-cryptsetup.target - Remote Encrypted Volumes. Nov 12 17:40:11.761500 systemd[1]: Reached target remote-fs.target - Remote File Systems. Nov 12 17:40:11.783444 systemd[1]: Starting dracut-pre-mount.service - dracut pre-mount hook... Nov 12 17:40:11.832126 systemd[1]: Finished dracut-pre-mount.service - dracut pre-mount hook. Nov 12 17:40:11.927656 kernel: ACPI: \_SB_.PCI0.GSI1: Enabled at IRQ 36 Nov 12 17:40:11.927743 kernel: ena 0000:00:05.0: enabling device (0010 -> 0012) Nov 12 17:40:11.961612 kernel: ena 0000:00:05.0: ENA device version: 0.10 Nov 12 17:40:11.961907 kernel: ena 0000:00:05.0: ENA controller version: 0.0.1 implementation version 1 Nov 12 17:40:11.962232 kernel: ACPI: \_SB_.PCI0.GSI0: Enabled at IRQ 35 Nov 12 17:40:11.962268 kernel: nvme nvme0: pci function 0000:00:04.0 Nov 12 17:40:11.962644 kernel: ena 0000:00:05.0: Elastic Network Adapter (ENA) found at mem 80114000, mac addr 06:4c:db:4d:eb:f1 Nov 12 17:40:11.941895 systemd[1]: dracut-cmdline-ask.service: Deactivated successfully. Nov 12 17:40:11.942421 systemd[1]: Stopped dracut-cmdline-ask.service - dracut ask for additional cmdline parameters. Nov 12 17:40:11.945977 systemd[1]: Stopping dracut-cmdline-ask.service - dracut ask for additional cmdline parameters... Nov 12 17:40:11.948283 systemd[1]: systemd-vconsole-setup.service: Deactivated successfully. Nov 12 17:40:11.948872 systemd[1]: Stopped systemd-vconsole-setup.service - Virtual Console Setup. Nov 12 17:40:11.951441 systemd[1]: Stopping systemd-vconsole-setup.service - Virtual Console Setup... Nov 12 17:40:11.963724 systemd[1]: Starting systemd-vconsole-setup.service - Virtual Console Setup... Nov 12 17:40:11.987215 kernel: nvme nvme0: 2/0/0 default/read/poll queues Nov 12 17:40:11.994107 kernel: GPT:Primary header thinks Alt. header is not at the end of the disk. Nov 12 17:40:11.994233 kernel: GPT:9289727 != 16777215 Nov 12 17:40:11.994268 kernel: GPT:Alternate GPT header not at the end of the disk. Nov 12 17:40:11.995964 kernel: GPT:9289727 != 16777215 Nov 12 17:40:11.996017 kernel: GPT: Use GNU Parted to correct GPT errors. Nov 12 17:40:11.996869 kernel: nvme0n1: p1 p2 p3 p4 p6 p7 p9 Nov 12 17:40:12.004781 (udev-worker)[540]: Network interface NamePolicy= disabled on kernel command line. Nov 12 17:40:12.030035 systemd[1]: Finished systemd-vconsole-setup.service - Virtual Console Setup. Nov 12 17:40:12.042561 systemd[1]: Starting dracut-cmdline-ask.service - dracut ask for additional cmdline parameters... Nov 12 17:40:12.112350 systemd[1]: Finished dracut-cmdline-ask.service - dracut ask for additional cmdline parameters. Nov 12 17:40:12.150180 kernel: BTRFS: device label OEM devid 1 transid 12 /dev/nvme0n1p6 scanned by (udev-worker) (538) Nov 12 17:40:12.166207 kernel: BTRFS: device fsid 93a9d474-e751-47b7-a65f-e39ca9abd47a devid 1 transid 40 /dev/nvme0n1p3 scanned by (udev-worker) (532) Nov 12 17:40:12.212459 systemd[1]: Found device dev-disk-by\x2dlabel-EFI\x2dSYSTEM.device - Amazon Elastic Block Store EFI-SYSTEM. Nov 12 17:40:12.260783 systemd[1]: Found device dev-disk-by\x2dlabel-ROOT.device - Amazon Elastic Block Store ROOT. Nov 12 17:40:12.293591 systemd[1]: Found device dev-disk-by\x2dlabel-OEM.device - Amazon Elastic Block Store OEM. Nov 12 17:40:12.322047 systemd[1]: Found device dev-disk-by\x2dpartuuid-7130c94a\x2d213a\x2d4e5a\x2d8e26\x2d6cce9662f132.device - Amazon Elastic Block Store USR-A. Nov 12 17:40:12.324951 systemd[1]: Found device dev-disk-by\x2dpartlabel-USR\x2dA.device - Amazon Elastic Block Store USR-A. Nov 12 17:40:12.340785 systemd[1]: Starting disk-uuid.service - Generate new UUID for disk GPT if necessary... Nov 12 17:40:12.372238 disk-uuid[659]: Primary Header is updated. Nov 12 17:40:12.372238 disk-uuid[659]: Secondary Entries is updated. Nov 12 17:40:12.372238 disk-uuid[659]: Secondary Header is updated. Nov 12 17:40:12.381215 kernel: nvme0n1: p1 p2 p3 p4 p6 p7 p9 Nov 12 17:40:12.391778 kernel: GPT:disk_guids don't match. Nov 12 17:40:12.391857 kernel: GPT: Use GNU Parted to correct GPT errors. Nov 12 17:40:12.391885 kernel: nvme0n1: p1 p2 p3 p4 p6 p7 p9 Nov 12 17:40:12.402188 kernel: nvme0n1: p1 p2 p3 p4 p6 p7 p9 Nov 12 17:40:13.404188 kernel: nvme0n1: p1 p2 p3 p4 p6 p7 p9 Nov 12 17:40:13.406224 disk-uuid[660]: The operation has completed successfully. Nov 12 17:40:13.622028 systemd[1]: disk-uuid.service: Deactivated successfully. Nov 12 17:40:13.622317 systemd[1]: Finished disk-uuid.service - Generate new UUID for disk GPT if necessary. Nov 12 17:40:13.673558 systemd[1]: Starting verity-setup.service - Verity Setup for /dev/mapper/usr... Nov 12 17:40:13.690971 sh[1003]: Success Nov 12 17:40:13.724464 kernel: device-mapper: verity: sha256 using implementation "sha256-ce" Nov 12 17:40:13.862204 systemd[1]: Found device dev-mapper-usr.device - /dev/mapper/usr. Nov 12 17:40:13.868331 systemd[1]: Mounting sysusr-usr.mount - /sysusr/usr... Nov 12 17:40:13.873848 systemd[1]: Finished verity-setup.service - Verity Setup for /dev/mapper/usr. Nov 12 17:40:13.918964 kernel: BTRFS info (device dm-0): first mount of filesystem 93a9d474-e751-47b7-a65f-e39ca9abd47a Nov 12 17:40:13.919062 kernel: BTRFS info (device dm-0): using crc32c (crc32c-generic) checksum algorithm Nov 12 17:40:13.919093 kernel: BTRFS warning (device dm-0): 'nologreplay' is deprecated, use 'rescue=nologreplay' instead Nov 12 17:40:13.922579 kernel: BTRFS info (device dm-0): disabling log replay at mount time Nov 12 17:40:13.922678 kernel: BTRFS info (device dm-0): using free space tree Nov 12 17:40:14.066186 kernel: BTRFS info (device dm-0): enabling ssd optimizations Nov 12 17:40:14.086658 systemd[1]: Mounted sysusr-usr.mount - /sysusr/usr. Nov 12 17:40:14.088655 systemd[1]: afterburn-network-kargs.service - Afterburn Initrd Setup Network Kernel Arguments was skipped because no trigger condition checks were met. Nov 12 17:40:14.099613 systemd[1]: Starting ignition-setup.service - Ignition (setup)... Nov 12 17:40:14.110749 systemd[1]: Starting parse-ip-for-networkd.service - Write systemd-networkd units from cmdline... Nov 12 17:40:14.143181 kernel: BTRFS info (device nvme0n1p6): first mount of filesystem 936a2172-6c61-4af6-a047-e38e0a3ff18b Nov 12 17:40:14.143268 kernel: BTRFS info (device nvme0n1p6): using crc32c (crc32c-generic) checksum algorithm Nov 12 17:40:14.144633 kernel: BTRFS info (device nvme0n1p6): using free space tree Nov 12 17:40:14.153177 kernel: BTRFS info (device nvme0n1p6): enabling ssd optimizations Nov 12 17:40:14.180234 systemd[1]: mnt-oem.mount: Deactivated successfully. Nov 12 17:40:14.183606 kernel: BTRFS info (device nvme0n1p6): last unmount of filesystem 936a2172-6c61-4af6-a047-e38e0a3ff18b Nov 12 17:40:14.208941 systemd[1]: Finished ignition-setup.service - Ignition (setup). Nov 12 17:40:14.221617 systemd[1]: Starting ignition-fetch-offline.service - Ignition (fetch-offline)... Nov 12 17:40:14.369807 systemd[1]: Finished parse-ip-for-networkd.service - Write systemd-networkd units from cmdline. Nov 12 17:40:14.383861 systemd[1]: Starting systemd-networkd.service - Network Configuration... Nov 12 17:40:14.456279 systemd-networkd[1196]: lo: Link UP Nov 12 17:40:14.457004 systemd-networkd[1196]: lo: Gained carrier Nov 12 17:40:14.461662 systemd-networkd[1196]: Enumeration completed Nov 12 17:40:14.461867 systemd[1]: Started systemd-networkd.service - Network Configuration. Nov 12 17:40:14.463916 systemd-networkd[1196]: eth0: found matching network '/usr/lib/systemd/network/zz-default.network', based on potentially unpredictable interface name. Nov 12 17:40:14.463925 systemd-networkd[1196]: eth0: Configuring with /usr/lib/systemd/network/zz-default.network. Nov 12 17:40:14.467560 systemd[1]: Reached target network.target - Network. Nov 12 17:40:14.481368 systemd-networkd[1196]: eth0: Link UP Nov 12 17:40:14.481376 systemd-networkd[1196]: eth0: Gained carrier Nov 12 17:40:14.481396 systemd-networkd[1196]: eth0: found matching network '/usr/lib/systemd/network/zz-default.network', based on potentially unpredictable interface name. Nov 12 17:40:14.501323 systemd-networkd[1196]: eth0: DHCPv4 address 172.31.30.96/20, gateway 172.31.16.1 acquired from 172.31.16.1 Nov 12 17:40:14.701283 ignition[1107]: Ignition 2.19.0 Nov 12 17:40:14.701327 ignition[1107]: Stage: fetch-offline Nov 12 17:40:14.702915 ignition[1107]: no configs at "/usr/lib/ignition/base.d" Nov 12 17:40:14.702942 ignition[1107]: no config dir at "/usr/lib/ignition/base.platform.d/aws" Nov 12 17:40:14.704130 ignition[1107]: Ignition finished successfully Nov 12 17:40:14.713493 systemd[1]: Finished ignition-fetch-offline.service - Ignition (fetch-offline). Nov 12 17:40:14.727686 systemd[1]: Starting ignition-fetch.service - Ignition (fetch)... Nov 12 17:40:14.772038 ignition[1207]: Ignition 2.19.0 Nov 12 17:40:14.772069 ignition[1207]: Stage: fetch Nov 12 17:40:14.774226 ignition[1207]: no configs at "/usr/lib/ignition/base.d" Nov 12 17:40:14.774269 ignition[1207]: no config dir at "/usr/lib/ignition/base.platform.d/aws" Nov 12 17:40:14.774756 ignition[1207]: PUT http://169.254.169.254/latest/api/token: attempt #1 Nov 12 17:40:14.803694 ignition[1207]: PUT result: OK Nov 12 17:40:14.807607 ignition[1207]: parsed url from cmdline: "" Nov 12 17:40:14.807631 ignition[1207]: no config URL provided Nov 12 17:40:14.807648 ignition[1207]: reading system config file "/usr/lib/ignition/user.ign" Nov 12 17:40:14.807678 ignition[1207]: no config at "/usr/lib/ignition/user.ign" Nov 12 17:40:14.807719 ignition[1207]: PUT http://169.254.169.254/latest/api/token: attempt #1 Nov 12 17:40:14.809586 ignition[1207]: PUT result: OK Nov 12 17:40:14.809691 ignition[1207]: GET http://169.254.169.254/2019-10-01/user-data: attempt #1 Nov 12 17:40:14.814228 ignition[1207]: GET result: OK Nov 12 17:40:14.814846 ignition[1207]: parsing config with SHA512: aaed3d3d61784756ec06cc8ad2d27a4b85d89caf1c38da2f2f7182444ff9aae03cdb7a6e28790a799d5524b1cd961c788044b297bd955c6e2dbb372fbd4111c4 Nov 12 17:40:14.835007 unknown[1207]: fetched base config from "system" Nov 12 17:40:14.835468 ignition[1207]: fetch: fetch complete Nov 12 17:40:14.835034 unknown[1207]: fetched base config from "system" Nov 12 17:40:14.835481 ignition[1207]: fetch: fetch passed Nov 12 17:40:14.835053 unknown[1207]: fetched user config from "aws" Nov 12 17:40:14.835603 ignition[1207]: Ignition finished successfully Nov 12 17:40:14.842658 systemd[1]: Finished ignition-fetch.service - Ignition (fetch). Nov 12 17:40:14.859755 systemd[1]: Starting ignition-kargs.service - Ignition (kargs)... Nov 12 17:40:14.896354 ignition[1214]: Ignition 2.19.0 Nov 12 17:40:14.896383 ignition[1214]: Stage: kargs Nov 12 17:40:14.897600 ignition[1214]: no configs at "/usr/lib/ignition/base.d" Nov 12 17:40:14.897950 ignition[1214]: no config dir at "/usr/lib/ignition/base.platform.d/aws" Nov 12 17:40:14.898170 ignition[1214]: PUT http://169.254.169.254/latest/api/token: attempt #1 Nov 12 17:40:14.900170 ignition[1214]: PUT result: OK Nov 12 17:40:14.908385 ignition[1214]: kargs: kargs passed Nov 12 17:40:14.914672 systemd[1]: Finished ignition-kargs.service - Ignition (kargs). Nov 12 17:40:14.908518 ignition[1214]: Ignition finished successfully Nov 12 17:40:14.937582 systemd[1]: Starting ignition-disks.service - Ignition (disks)... Nov 12 17:40:14.978947 ignition[1220]: Ignition 2.19.0 Nov 12 17:40:14.979006 ignition[1220]: Stage: disks Nov 12 17:40:14.980698 ignition[1220]: no configs at "/usr/lib/ignition/base.d" Nov 12 17:40:14.980755 ignition[1220]: no config dir at "/usr/lib/ignition/base.platform.d/aws" Nov 12 17:40:14.981076 ignition[1220]: PUT http://169.254.169.254/latest/api/token: attempt #1 Nov 12 17:40:14.986490 ignition[1220]: PUT result: OK Nov 12 17:40:14.996556 ignition[1220]: disks: disks passed Nov 12 17:40:14.996747 ignition[1220]: Ignition finished successfully Nov 12 17:40:15.002243 systemd[1]: Finished ignition-disks.service - Ignition (disks). Nov 12 17:40:15.006691 systemd[1]: Reached target initrd-root-device.target - Initrd Root Device. Nov 12 17:40:15.009228 systemd[1]: Reached target local-fs-pre.target - Preparation for Local File Systems. Nov 12 17:40:15.011784 systemd[1]: Reached target local-fs.target - Local File Systems. Nov 12 17:40:15.013886 systemd[1]: Reached target sysinit.target - System Initialization. Nov 12 17:40:15.016018 systemd[1]: Reached target basic.target - Basic System. Nov 12 17:40:15.036367 systemd[1]: Starting systemd-fsck-root.service - File System Check on /dev/disk/by-label/ROOT... Nov 12 17:40:15.087743 systemd-fsck[1228]: ROOT: clean, 14/553520 files, 52654/553472 blocks Nov 12 17:40:15.099127 systemd[1]: Finished systemd-fsck-root.service - File System Check on /dev/disk/by-label/ROOT. Nov 12 17:40:15.109586 systemd[1]: Mounting sysroot.mount - /sysroot... Nov 12 17:40:15.211242 kernel: EXT4-fs (nvme0n1p9): mounted filesystem b3af0fd7-3c7c-4cdc-9b88-dae3d10ea922 r/w with ordered data mode. Quota mode: none. Nov 12 17:40:15.212987 systemd[1]: Mounted sysroot.mount - /sysroot. Nov 12 17:40:15.217728 systemd[1]: Reached target initrd-root-fs.target - Initrd Root File System. Nov 12 17:40:15.238446 systemd[1]: Mounting sysroot-oem.mount - /sysroot/oem... Nov 12 17:40:15.252777 systemd[1]: Mounting sysroot-usr.mount - /sysroot/usr... Nov 12 17:40:15.255889 systemd[1]: flatcar-metadata-hostname.service - Flatcar Metadata Hostname Agent was skipped because no trigger condition checks were met. Nov 12 17:40:15.256013 systemd[1]: ignition-remount-sysroot.service - Remount /sysroot read-write for Ignition was skipped because of an unmet condition check (ConditionPathIsReadWrite=!/sysroot). Nov 12 17:40:15.256082 systemd[1]: Reached target ignition-diskful.target - Ignition Boot Disk Setup. Nov 12 17:40:15.293744 kernel: BTRFS: device label OEM devid 1 transid 13 /dev/nvme0n1p6 scanned by mount (1247) Nov 12 17:40:15.293789 kernel: BTRFS info (device nvme0n1p6): first mount of filesystem 936a2172-6c61-4af6-a047-e38e0a3ff18b Nov 12 17:40:15.293818 kernel: BTRFS info (device nvme0n1p6): using crc32c (crc32c-generic) checksum algorithm Nov 12 17:40:15.293848 kernel: BTRFS info (device nvme0n1p6): using free space tree Nov 12 17:40:15.284391 systemd[1]: Mounted sysroot-usr.mount - /sysroot/usr. Nov 12 17:40:15.299198 kernel: BTRFS info (device nvme0n1p6): enabling ssd optimizations Nov 12 17:40:15.301460 systemd[1]: Starting initrd-setup-root.service - Root filesystem setup... Nov 12 17:40:15.308593 systemd[1]: Mounted sysroot-oem.mount - /sysroot/oem. Nov 12 17:40:15.844461 systemd-networkd[1196]: eth0: Gained IPv6LL Nov 12 17:40:15.865095 initrd-setup-root[1271]: cut: /sysroot/etc/passwd: No such file or directory Nov 12 17:40:15.889828 initrd-setup-root[1278]: cut: /sysroot/etc/group: No such file or directory Nov 12 17:40:15.902034 initrd-setup-root[1285]: cut: /sysroot/etc/shadow: No such file or directory Nov 12 17:40:15.914856 initrd-setup-root[1292]: cut: /sysroot/etc/gshadow: No such file or directory Nov 12 17:40:16.339224 systemd[1]: Finished initrd-setup-root.service - Root filesystem setup. Nov 12 17:40:16.349303 systemd[1]: Starting ignition-mount.service - Ignition (mount)... Nov 12 17:40:16.355900 systemd[1]: Starting sysroot-boot.service - /sysroot/boot... Nov 12 17:40:16.378874 systemd[1]: sysroot-oem.mount: Deactivated successfully. Nov 12 17:40:16.383330 kernel: BTRFS info (device nvme0n1p6): last unmount of filesystem 936a2172-6c61-4af6-a047-e38e0a3ff18b Nov 12 17:40:16.430488 systemd[1]: Finished sysroot-boot.service - /sysroot/boot. Nov 12 17:40:16.442226 ignition[1360]: INFO : Ignition 2.19.0 Nov 12 17:40:16.445116 ignition[1360]: INFO : Stage: mount Nov 12 17:40:16.445116 ignition[1360]: INFO : no configs at "/usr/lib/ignition/base.d" Nov 12 17:40:16.445116 ignition[1360]: INFO : no config dir at "/usr/lib/ignition/base.platform.d/aws" Nov 12 17:40:16.445116 ignition[1360]: INFO : PUT http://169.254.169.254/latest/api/token: attempt #1 Nov 12 17:40:16.453364 ignition[1360]: INFO : PUT result: OK Nov 12 17:40:16.458048 ignition[1360]: INFO : mount: mount passed Nov 12 17:40:16.459761 ignition[1360]: INFO : Ignition finished successfully Nov 12 17:40:16.465227 systemd[1]: Finished ignition-mount.service - Ignition (mount). Nov 12 17:40:16.475351 systemd[1]: Starting ignition-files.service - Ignition (files)... Nov 12 17:40:16.509654 systemd[1]: Mounting sysroot-oem.mount - /sysroot/oem... Nov 12 17:40:16.542234 kernel: BTRFS: device label OEM devid 1 transid 14 /dev/nvme0n1p6 scanned by mount (1372) Nov 12 17:40:16.546265 kernel: BTRFS info (device nvme0n1p6): first mount of filesystem 936a2172-6c61-4af6-a047-e38e0a3ff18b Nov 12 17:40:16.546415 kernel: BTRFS info (device nvme0n1p6): using crc32c (crc32c-generic) checksum algorithm Nov 12 17:40:16.546458 kernel: BTRFS info (device nvme0n1p6): using free space tree Nov 12 17:40:16.553218 kernel: BTRFS info (device nvme0n1p6): enabling ssd optimizations Nov 12 17:40:16.558282 systemd[1]: Mounted sysroot-oem.mount - /sysroot/oem. Nov 12 17:40:16.611898 ignition[1389]: INFO : Ignition 2.19.0 Nov 12 17:40:16.611898 ignition[1389]: INFO : Stage: files Nov 12 17:40:16.615545 ignition[1389]: INFO : no configs at "/usr/lib/ignition/base.d" Nov 12 17:40:16.615545 ignition[1389]: INFO : no config dir at "/usr/lib/ignition/base.platform.d/aws" Nov 12 17:40:16.620257 ignition[1389]: INFO : PUT http://169.254.169.254/latest/api/token: attempt #1 Nov 12 17:40:16.624219 ignition[1389]: INFO : PUT result: OK Nov 12 17:40:16.629019 ignition[1389]: DEBUG : files: compiled without relabeling support, skipping Nov 12 17:40:16.631883 ignition[1389]: INFO : files: ensureUsers: op(1): [started] creating or modifying user "core" Nov 12 17:40:16.634881 ignition[1389]: DEBUG : files: ensureUsers: op(1): executing: "usermod" "--root" "/sysroot" "core" Nov 12 17:40:16.652912 ignition[1389]: INFO : files: ensureUsers: op(1): [finished] creating or modifying user "core" Nov 12 17:40:16.656097 ignition[1389]: INFO : files: ensureUsers: op(2): [started] adding ssh keys to user "core" Nov 12 17:40:16.659578 unknown[1389]: wrote ssh authorized keys file for user: core Nov 12 17:40:16.662515 ignition[1389]: INFO : files: ensureUsers: op(2): [finished] adding ssh keys to user "core" Nov 12 17:40:16.665812 ignition[1389]: INFO : files: createFilesystemsFiles: createFiles: op(3): [started] writing file "/sysroot/etc/flatcar/update.conf" Nov 12 17:40:16.669431 ignition[1389]: INFO : files: createFilesystemsFiles: createFiles: op(3): [finished] writing file "/sysroot/etc/flatcar/update.conf" Nov 12 17:40:16.669431 ignition[1389]: INFO : files: op(4): [started] processing unit "etcd-member.service" Nov 12 17:40:16.682417 ignition[1389]: INFO : files: op(4): op(5): [started] writing systemd drop-in "20-clct-etcd-member.conf" at "/sysroot/etc/systemd/system/etcd-member.service.d/20-clct-etcd-member.conf" Nov 12 17:40:16.687409 ignition[1389]: INFO : files: op(4): op(5): [finished] writing systemd drop-in "20-clct-etcd-member.conf" at "/sysroot/etc/systemd/system/etcd-member.service.d/20-clct-etcd-member.conf" Nov 12 17:40:16.687409 ignition[1389]: INFO : files: op(4): [finished] processing unit "etcd-member.service" Nov 12 17:40:16.687409 ignition[1389]: INFO : files: op(6): [started] setting preset to enabled for "etcd-member.service" Nov 12 17:40:16.687409 ignition[1389]: INFO : files: op(6): [finished] setting preset to enabled for "etcd-member.service" Nov 12 17:40:16.687409 ignition[1389]: INFO : files: createResultFile: createFiles: op(7): [started] writing file "/sysroot/etc/.ignition-result.json" Nov 12 17:40:16.704734 ignition[1389]: INFO : files: createResultFile: createFiles: op(7): [finished] writing file "/sysroot/etc/.ignition-result.json" Nov 12 17:40:16.704734 ignition[1389]: INFO : files: files passed Nov 12 17:40:16.704734 ignition[1389]: INFO : Ignition finished successfully Nov 12 17:40:16.706023 systemd[1]: Finished ignition-files.service - Ignition (files). Nov 12 17:40:16.742681 systemd[1]: Starting ignition-quench.service - Ignition (record completion)... Nov 12 17:40:16.750399 systemd[1]: Starting initrd-setup-root-after-ignition.service - Root filesystem completion... Nov 12 17:40:16.763670 systemd[1]: ignition-quench.service: Deactivated successfully. Nov 12 17:40:16.766452 systemd[1]: Finished ignition-quench.service - Ignition (record completion). Nov 12 17:40:16.793209 initrd-setup-root-after-ignition[1417]: grep: /sysroot/etc/flatcar/enabled-sysext.conf: No such file or directory Nov 12 17:40:16.793209 initrd-setup-root-after-ignition[1417]: grep: /sysroot/usr/share/flatcar/enabled-sysext.conf: No such file or directory Nov 12 17:40:16.801393 initrd-setup-root-after-ignition[1421]: grep: /sysroot/etc/flatcar/enabled-sysext.conf: No such file or directory Nov 12 17:40:16.814221 systemd[1]: Finished initrd-setup-root-after-ignition.service - Root filesystem completion. Nov 12 17:40:16.817737 systemd[1]: Reached target ignition-complete.target - Ignition Complete. Nov 12 17:40:16.835645 systemd[1]: Starting initrd-parse-etc.service - Mountpoints Configured in the Real Root... Nov 12 17:40:16.911645 systemd[1]: initrd-parse-etc.service: Deactivated successfully. Nov 12 17:40:16.913795 systemd[1]: Finished initrd-parse-etc.service - Mountpoints Configured in the Real Root. Nov 12 17:40:16.919202 systemd[1]: Reached target initrd-fs.target - Initrd File Systems. Nov 12 17:40:16.923339 systemd[1]: Reached target initrd.target - Initrd Default Target. Nov 12 17:40:16.927132 systemd[1]: dracut-mount.service - dracut mount hook was skipped because no trigger condition checks were met. Nov 12 17:40:16.935579 systemd[1]: Starting dracut-pre-pivot.service - dracut pre-pivot and cleanup hook... Nov 12 17:40:16.981215 systemd[1]: Finished dracut-pre-pivot.service - dracut pre-pivot and cleanup hook. Nov 12 17:40:17.004775 systemd[1]: Starting initrd-cleanup.service - Cleaning Up and Shutting Down Daemons... Nov 12 17:40:17.033685 systemd[1]: Stopped target nss-lookup.target - Host and Network Name Lookups. Nov 12 17:40:17.039086 systemd[1]: Stopped target remote-cryptsetup.target - Remote Encrypted Volumes. Nov 12 17:40:17.044301 systemd[1]: Stopped target timers.target - Timer Units. Nov 12 17:40:17.046824 systemd[1]: dracut-pre-pivot.service: Deactivated successfully. Nov 12 17:40:17.047119 systemd[1]: Stopped dracut-pre-pivot.service - dracut pre-pivot and cleanup hook. Nov 12 17:40:17.057427 systemd[1]: Stopped target initrd.target - Initrd Default Target. Nov 12 17:40:17.058339 systemd[1]: Stopped target basic.target - Basic System. Nov 12 17:40:17.065828 systemd[1]: Stopped target ignition-complete.target - Ignition Complete. Nov 12 17:40:17.069977 systemd[1]: Stopped target ignition-diskful.target - Ignition Boot Disk Setup. Nov 12 17:40:17.074875 systemd[1]: Stopped target initrd-root-device.target - Initrd Root Device. Nov 12 17:40:17.082719 systemd[1]: Stopped target remote-fs.target - Remote File Systems. Nov 12 17:40:17.086447 systemd[1]: Stopped target remote-fs-pre.target - Preparation for Remote File Systems. Nov 12 17:40:17.090119 systemd[1]: Stopped target sysinit.target - System Initialization. Nov 12 17:40:17.091075 systemd[1]: Stopped target local-fs.target - Local File Systems. Nov 12 17:40:17.092289 systemd[1]: Stopped target swap.target - Swaps. Nov 12 17:40:17.093217 systemd[1]: dracut-pre-mount.service: Deactivated successfully. Nov 12 17:40:17.093698 systemd[1]: Stopped dracut-pre-mount.service - dracut pre-mount hook. Nov 12 17:40:17.095437 systemd[1]: Stopped target cryptsetup.target - Local Encrypted Volumes. Nov 12 17:40:17.096744 systemd[1]: Stopped target cryptsetup-pre.target - Local Encrypted Volumes (Pre). Nov 12 17:40:17.097930 systemd[1]: clevis-luks-askpass.path: Deactivated successfully. Nov 12 17:40:17.101944 systemd[1]: Stopped clevis-luks-askpass.path - Forward Password Requests to Clevis Directory Watch. Nov 12 17:40:17.104975 systemd[1]: dracut-initqueue.service: Deactivated successfully. Nov 12 17:40:17.105348 systemd[1]: Stopped dracut-initqueue.service - dracut initqueue hook. Nov 12 17:40:17.110278 systemd[1]: initrd-setup-root-after-ignition.service: Deactivated successfully. Nov 12 17:40:17.111129 systemd[1]: Stopped initrd-setup-root-after-ignition.service - Root filesystem completion. Nov 12 17:40:17.116637 systemd[1]: ignition-files.service: Deactivated successfully. Nov 12 17:40:17.116948 systemd[1]: Stopped ignition-files.service - Ignition (files). Nov 12 17:40:17.132205 systemd[1]: Stopping ignition-mount.service - Ignition (mount)... Nov 12 17:40:17.160997 systemd[1]: Stopping sysroot-boot.service - /sysroot/boot... Nov 12 17:40:17.171265 systemd[1]: systemd-udev-trigger.service: Deactivated successfully. Nov 12 17:40:17.171620 systemd[1]: Stopped systemd-udev-trigger.service - Coldplug All udev Devices. Nov 12 17:40:17.173625 systemd[1]: dracut-pre-trigger.service: Deactivated successfully. Nov 12 17:40:17.174037 systemd[1]: Stopped dracut-pre-trigger.service - dracut pre-trigger hook. Nov 12 17:40:17.222992 systemd[1]: initrd-cleanup.service: Deactivated successfully. Nov 12 17:40:17.226713 systemd[1]: Finished initrd-cleanup.service - Cleaning Up and Shutting Down Daemons. Nov 12 17:40:17.238211 ignition[1441]: INFO : Ignition 2.19.0 Nov 12 17:40:17.247368 ignition[1441]: INFO : Stage: umount Nov 12 17:40:17.247368 ignition[1441]: INFO : no configs at "/usr/lib/ignition/base.d" Nov 12 17:40:17.247368 ignition[1441]: INFO : no config dir at "/usr/lib/ignition/base.platform.d/aws" Nov 12 17:40:17.247368 ignition[1441]: INFO : PUT http://169.254.169.254/latest/api/token: attempt #1 Nov 12 17:40:17.258806 systemd[1]: sysroot-boot.mount: Deactivated successfully. Nov 12 17:40:17.263848 ignition[1441]: INFO : PUT result: OK Nov 12 17:40:17.265939 systemd[1]: sysroot-boot.service: Deactivated successfully. Nov 12 17:40:17.268233 systemd[1]: Stopped sysroot-boot.service - /sysroot/boot. Nov 12 17:40:17.274776 ignition[1441]: INFO : umount: umount passed Nov 12 17:40:17.276785 ignition[1441]: INFO : Ignition finished successfully Nov 12 17:40:17.281364 systemd[1]: ignition-mount.service: Deactivated successfully. Nov 12 17:40:17.283309 systemd[1]: Stopped ignition-mount.service - Ignition (mount). Nov 12 17:40:17.286560 systemd[1]: ignition-disks.service: Deactivated successfully. Nov 12 17:40:17.286679 systemd[1]: Stopped ignition-disks.service - Ignition (disks). Nov 12 17:40:17.289524 systemd[1]: ignition-kargs.service: Deactivated successfully. Nov 12 17:40:17.289653 systemd[1]: Stopped ignition-kargs.service - Ignition (kargs). Nov 12 17:40:17.294098 systemd[1]: ignition-fetch.service: Deactivated successfully. Nov 12 17:40:17.294369 systemd[1]: Stopped ignition-fetch.service - Ignition (fetch). Nov 12 17:40:17.297537 systemd[1]: Stopped target network.target - Network. Nov 12 17:40:17.298860 systemd[1]: ignition-fetch-offline.service: Deactivated successfully. Nov 12 17:40:17.299045 systemd[1]: Stopped ignition-fetch-offline.service - Ignition (fetch-offline). Nov 12 17:40:17.320031 systemd[1]: Stopped target paths.target - Path Units. Nov 12 17:40:17.322258 systemd[1]: systemd-ask-password-console.path: Deactivated successfully. Nov 12 17:40:17.326326 systemd[1]: Stopped systemd-ask-password-console.path - Dispatch Password Requests to Console Directory Watch. Nov 12 17:40:17.332042 systemd[1]: Stopped target slices.target - Slice Units. Nov 12 17:40:17.333031 systemd[1]: Stopped target sockets.target - Socket Units. Nov 12 17:40:17.333847 systemd[1]: iscsid.socket: Deactivated successfully. Nov 12 17:40:17.333966 systemd[1]: Closed iscsid.socket - Open-iSCSI iscsid Socket. Nov 12 17:40:17.345166 systemd[1]: iscsiuio.socket: Deactivated successfully. Nov 12 17:40:17.345290 systemd[1]: Closed iscsiuio.socket - Open-iSCSI iscsiuio Socket. Nov 12 17:40:17.347454 systemd[1]: ignition-setup.service: Deactivated successfully. Nov 12 17:40:17.347612 systemd[1]: Stopped ignition-setup.service - Ignition (setup). Nov 12 17:40:17.351429 systemd[1]: ignition-setup-pre.service: Deactivated successfully. Nov 12 17:40:17.351533 systemd[1]: Stopped ignition-setup-pre.service - Ignition env setup. Nov 12 17:40:17.353648 systemd[1]: initrd-setup-root.service: Deactivated successfully. Nov 12 17:40:17.353746 systemd[1]: Stopped initrd-setup-root.service - Root filesystem setup. Nov 12 17:40:17.356300 systemd[1]: Stopping systemd-networkd.service - Network Configuration... Nov 12 17:40:17.360035 systemd[1]: Stopping systemd-resolved.service - Network Name Resolution... Nov 12 17:40:17.366531 systemd-networkd[1196]: eth0: DHCPv6 lease lost Nov 12 17:40:17.384123 systemd[1]: systemd-networkd.service: Deactivated successfully. Nov 12 17:40:17.385022 systemd[1]: Stopped systemd-networkd.service - Network Configuration. Nov 12 17:40:17.391696 systemd[1]: systemd-resolved.service: Deactivated successfully. Nov 12 17:40:17.392253 systemd[1]: Stopped systemd-resolved.service - Network Name Resolution. Nov 12 17:40:17.401761 systemd[1]: systemd-networkd.socket: Deactivated successfully. Nov 12 17:40:17.402330 systemd[1]: Closed systemd-networkd.socket - Network Service Netlink Socket. Nov 12 17:40:17.415483 systemd[1]: Stopping network-cleanup.service - Network Cleanup... Nov 12 17:40:17.422926 systemd[1]: parse-ip-for-networkd.service: Deactivated successfully. Nov 12 17:40:17.423107 systemd[1]: Stopped parse-ip-for-networkd.service - Write systemd-networkd units from cmdline. Nov 12 17:40:17.425810 systemd[1]: systemd-sysctl.service: Deactivated successfully. Nov 12 17:40:17.425924 systemd[1]: Stopped systemd-sysctl.service - Apply Kernel Variables. Nov 12 17:40:17.428607 systemd[1]: systemd-modules-load.service: Deactivated successfully. Nov 12 17:40:17.428774 systemd[1]: Stopped systemd-modules-load.service - Load Kernel Modules. Nov 12 17:40:17.431573 systemd[1]: systemd-tmpfiles-setup.service: Deactivated successfully. Nov 12 17:40:17.431683 systemd[1]: Stopped systemd-tmpfiles-setup.service - Create System Files and Directories. Nov 12 17:40:17.434754 systemd[1]: Stopping systemd-udevd.service - Rule-based Manager for Device Events and Files... Nov 12 17:40:17.478022 systemd[1]: systemd-udevd.service: Deactivated successfully. Nov 12 17:40:17.480198 systemd[1]: Stopped systemd-udevd.service - Rule-based Manager for Device Events and Files. Nov 12 17:40:17.488722 systemd[1]: systemd-udevd-control.socket: Deactivated successfully. Nov 12 17:40:17.488936 systemd[1]: Closed systemd-udevd-control.socket - udev Control Socket. Nov 12 17:40:17.491468 systemd[1]: systemd-udevd-kernel.socket: Deactivated successfully. Nov 12 17:40:17.491556 systemd[1]: Closed systemd-udevd-kernel.socket - udev Kernel Socket. Nov 12 17:40:17.493800 systemd[1]: dracut-pre-udev.service: Deactivated successfully. Nov 12 17:40:17.495904 systemd[1]: Stopped dracut-pre-udev.service - dracut pre-udev hook. Nov 12 17:40:17.504412 systemd[1]: dracut-cmdline.service: Deactivated successfully. Nov 12 17:40:17.506245 systemd[1]: Stopped dracut-cmdline.service - dracut cmdline hook. Nov 12 17:40:17.513561 systemd[1]: dracut-cmdline-ask.service: Deactivated successfully. Nov 12 17:40:17.513682 systemd[1]: Stopped dracut-cmdline-ask.service - dracut ask for additional cmdline parameters. Nov 12 17:40:17.527420 systemd[1]: Starting initrd-udevadm-cleanup-db.service - Cleanup udev Database... Nov 12 17:40:17.533609 systemd[1]: systemd-tmpfiles-setup-dev.service: Deactivated successfully. Nov 12 17:40:17.533771 systemd[1]: Stopped systemd-tmpfiles-setup-dev.service - Create Static Device Nodes in /dev. Nov 12 17:40:17.536345 systemd[1]: systemd-tmpfiles-setup-dev-early.service: Deactivated successfully. Nov 12 17:40:17.536437 systemd[1]: Stopped systemd-tmpfiles-setup-dev-early.service - Create Static Device Nodes in /dev gracefully. Nov 12 17:40:17.539353 systemd[1]: kmod-static-nodes.service: Deactivated successfully. Nov 12 17:40:17.539436 systemd[1]: Stopped kmod-static-nodes.service - Create List of Static Device Nodes. Nov 12 17:40:17.542317 systemd[1]: systemd-vconsole-setup.service: Deactivated successfully. Nov 12 17:40:17.542408 systemd[1]: Stopped systemd-vconsole-setup.service - Virtual Console Setup. Nov 12 17:40:17.545729 systemd[1]: network-cleanup.service: Deactivated successfully. Nov 12 17:40:17.546358 systemd[1]: Stopped network-cleanup.service - Network Cleanup. Nov 12 17:40:17.594679 systemd[1]: initrd-udevadm-cleanup-db.service: Deactivated successfully. Nov 12 17:40:17.596375 systemd[1]: Finished initrd-udevadm-cleanup-db.service - Cleanup udev Database. Nov 12 17:40:17.602828 systemd[1]: Reached target initrd-switch-root.target - Switch Root. Nov 12 17:40:17.619763 systemd[1]: Starting initrd-switch-root.service - Switch Root... Nov 12 17:40:17.636355 systemd[1]: Switching root. Nov 12 17:40:17.678964 systemd-journald[250]: Journal stopped Nov 12 17:40:20.587818 systemd-journald[250]: Received SIGTERM from PID 1 (systemd). Nov 12 17:40:20.588076 kernel: SELinux: policy capability network_peer_controls=1 Nov 12 17:40:20.588237 kernel: SELinux: policy capability open_perms=1 Nov 12 17:40:20.588320 kernel: SELinux: policy capability extended_socket_class=1 Nov 12 17:40:20.588382 kernel: SELinux: policy capability always_check_network=0 Nov 12 17:40:20.588424 kernel: SELinux: policy capability cgroup_seclabel=1 Nov 12 17:40:20.588466 kernel: SELinux: policy capability nnp_nosuid_transition=1 Nov 12 17:40:20.588503 kernel: SELinux: policy capability genfs_seclabel_symlinks=0 Nov 12 17:40:20.588540 kernel: SELinux: policy capability ioctl_skip_cloexec=0 Nov 12 17:40:20.588579 kernel: audit: type=1403 audit(1731433218.215:2): auid=4294967295 ses=4294967295 lsm=selinux res=1 Nov 12 17:40:20.588640 systemd[1]: Successfully loaded SELinux policy in 101.192ms. Nov 12 17:40:20.588707 systemd[1]: Relabeled /dev, /dev/shm, /run, /sys/fs/cgroup in 39.142ms. Nov 12 17:40:20.588771 systemd[1]: systemd 255 running in system mode (+PAM +AUDIT +SELINUX -APPARMOR +IMA +SMACK +SECCOMP +GCRYPT -GNUTLS +OPENSSL -ACL +BLKID +CURL +ELFUTILS -FIDO2 +IDN2 -IDN +IPTC +KMOD +LIBCRYPTSETUP +LIBFDISK +PCRE2 -PWQUALITY -P11KIT -QRENCODE +TPM2 +BZIP2 +LZ4 +XZ +ZLIB +ZSTD -BPF_FRAMEWORK -XKBCOMMON +UTMP -SYSVINIT default-hierarchy=unified) Nov 12 17:40:20.588841 systemd[1]: Detected virtualization amazon. Nov 12 17:40:20.588879 systemd[1]: Detected architecture arm64. Nov 12 17:40:20.588917 systemd[1]: Detected first boot. Nov 12 17:40:20.588956 systemd[1]: Initializing machine ID from VM UUID. Nov 12 17:40:20.588994 zram_generator::config[1484]: No configuration found. Nov 12 17:40:20.589034 systemd[1]: Populated /etc with preset unit settings. Nov 12 17:40:20.589065 systemd[1]: initrd-switch-root.service: Deactivated successfully. Nov 12 17:40:20.589104 systemd[1]: Stopped initrd-switch-root.service - Switch Root. Nov 12 17:40:20.594109 systemd[1]: systemd-journald.service: Scheduled restart job, restart counter is at 1. Nov 12 17:40:20.594259 systemd[1]: Created slice system-addon\x2dconfig.slice - Slice /system/addon-config. Nov 12 17:40:20.594311 systemd[1]: Created slice system-addon\x2drun.slice - Slice /system/addon-run. Nov 12 17:40:20.594344 systemd[1]: Created slice system-getty.slice - Slice /system/getty. Nov 12 17:40:20.594379 systemd[1]: Created slice system-modprobe.slice - Slice /system/modprobe. Nov 12 17:40:20.594421 systemd[1]: Created slice system-serial\x2dgetty.slice - Slice /system/serial-getty. Nov 12 17:40:20.594455 systemd[1]: Created slice system-system\x2dcloudinit.slice - Slice /system/system-cloudinit. Nov 12 17:40:20.594488 systemd[1]: Created slice system-systemd\x2dfsck.slice - Slice /system/systemd-fsck. Nov 12 17:40:20.594521 systemd[1]: Created slice user.slice - User and Session Slice. Nov 12 17:40:20.594551 systemd[1]: Started clevis-luks-askpass.path - Forward Password Requests to Clevis Directory Watch. Nov 12 17:40:20.594586 systemd[1]: Started systemd-ask-password-console.path - Dispatch Password Requests to Console Directory Watch. Nov 12 17:40:20.594618 systemd[1]: Started systemd-ask-password-wall.path - Forward Password Requests to Wall Directory Watch. Nov 12 17:40:20.594651 systemd[1]: Set up automount boot.automount - Boot partition Automount Point. Nov 12 17:40:20.594687 systemd[1]: Set up automount proc-sys-fs-binfmt_misc.automount - Arbitrary Executable File Formats File System Automount Point. Nov 12 17:40:20.594723 systemd[1]: Expecting device dev-disk-by\x2dlabel-OEM.device - /dev/disk/by-label/OEM... Nov 12 17:40:20.594758 systemd[1]: Expecting device dev-ttyS0.device - /dev/ttyS0... Nov 12 17:40:20.594795 systemd[1]: Reached target cryptsetup-pre.target - Local Encrypted Volumes (Pre). Nov 12 17:40:20.594829 systemd[1]: Stopped target initrd-switch-root.target - Switch Root. Nov 12 17:40:20.594865 systemd[1]: Stopped target initrd-fs.target - Initrd File Systems. Nov 12 17:40:20.594906 systemd[1]: Stopped target initrd-root-fs.target - Initrd Root File System. Nov 12 17:40:20.594941 systemd[1]: Reached target integritysetup.target - Local Integrity Protected Volumes. Nov 12 17:40:20.594984 systemd[1]: Reached target remote-cryptsetup.target - Remote Encrypted Volumes. Nov 12 17:40:20.595026 systemd[1]: Reached target remote-fs.target - Remote File Systems. Nov 12 17:40:20.595069 systemd[1]: Reached target slices.target - Slice Units. Nov 12 17:40:20.595110 systemd[1]: Reached target swap.target - Swaps. Nov 12 17:40:20.596772 systemd[1]: Reached target veritysetup.target - Local Verity Protected Volumes. Nov 12 17:40:20.596872 systemd[1]: Listening on systemd-coredump.socket - Process Core Dump Socket. Nov 12 17:40:20.596911 systemd[1]: Listening on systemd-networkd.socket - Network Service Netlink Socket. Nov 12 17:40:20.596946 systemd[1]: Listening on systemd-udevd-control.socket - udev Control Socket. Nov 12 17:40:20.596978 systemd[1]: Listening on systemd-udevd-kernel.socket - udev Kernel Socket. Nov 12 17:40:20.597010 systemd[1]: Listening on systemd-userdbd.socket - User Database Manager Socket. Nov 12 17:40:20.597068 systemd[1]: Mounting dev-hugepages.mount - Huge Pages File System... Nov 12 17:40:20.597108 systemd[1]: Mounting dev-mqueue.mount - POSIX Message Queue File System... Nov 12 17:40:20.599228 systemd[1]: Mounting media.mount - External Media Directory... Nov 12 17:40:20.599309 systemd[1]: Mounting sys-kernel-debug.mount - Kernel Debug File System... Nov 12 17:40:20.599351 systemd[1]: Mounting sys-kernel-tracing.mount - Kernel Trace File System... Nov 12 17:40:20.599384 systemd[1]: Mounting tmp.mount - Temporary Directory /tmp... Nov 12 17:40:20.599422 systemd[1]: var-lib-machines.mount - Virtual Machine and Container Storage (Compatibility) was skipped because of an unmet condition check (ConditionPathExists=/var/lib/machines.raw). Nov 12 17:40:20.599457 systemd[1]: Reached target machines.target - Containers. Nov 12 17:40:20.599510 systemd[1]: Starting flatcar-tmpfiles.service - Create missing system files... Nov 12 17:40:20.599546 systemd[1]: ignition-delete-config.service - Ignition (delete config) was skipped because no trigger condition checks were met. Nov 12 17:40:20.599578 systemd[1]: Starting kmod-static-nodes.service - Create List of Static Device Nodes... Nov 12 17:40:20.599613 systemd[1]: Starting modprobe@configfs.service - Load Kernel Module configfs... Nov 12 17:40:20.599647 systemd[1]: Starting modprobe@dm_mod.service - Load Kernel Module dm_mod... Nov 12 17:40:20.599707 systemd[1]: Starting modprobe@drm.service - Load Kernel Module drm... Nov 12 17:40:20.599743 systemd[1]: Starting modprobe@efi_pstore.service - Load Kernel Module efi_pstore... Nov 12 17:40:20.599782 systemd[1]: Starting modprobe@fuse.service - Load Kernel Module fuse... Nov 12 17:40:20.599816 systemd[1]: Starting modprobe@loop.service - Load Kernel Module loop... Nov 12 17:40:20.599858 systemd[1]: setup-nsswitch.service - Create /etc/nsswitch.conf was skipped because of an unmet condition check (ConditionPathExists=!/etc/nsswitch.conf). Nov 12 17:40:20.599891 systemd[1]: systemd-fsck-root.service: Deactivated successfully. Nov 12 17:40:20.599925 systemd[1]: Stopped systemd-fsck-root.service - File System Check on Root Device. Nov 12 17:40:20.599969 systemd[1]: systemd-fsck-usr.service: Deactivated successfully. Nov 12 17:40:20.600011 systemd[1]: Stopped systemd-fsck-usr.service. Nov 12 17:40:20.600046 systemd[1]: Starting systemd-journald.service - Journal Service... Nov 12 17:40:20.600081 kernel: fuse: init (API version 7.39) Nov 12 17:40:20.600118 systemd[1]: Starting systemd-modules-load.service - Load Kernel Modules... Nov 12 17:40:20.600203 systemd[1]: Starting systemd-network-generator.service - Generate network units from Kernel command line... Nov 12 17:40:20.603261 systemd[1]: Starting systemd-remount-fs.service - Remount Root and Kernel File Systems... Nov 12 17:40:20.603365 kernel: loop: module loaded Nov 12 17:40:20.603410 systemd[1]: Starting systemd-udev-trigger.service - Coldplug All udev Devices... Nov 12 17:40:20.603454 kernel: ACPI: bus type drm_connector registered Nov 12 17:40:20.603494 systemd[1]: verity-setup.service: Deactivated successfully. Nov 12 17:40:20.603541 systemd[1]: Stopped verity-setup.service. Nov 12 17:40:20.603579 systemd[1]: Mounted dev-hugepages.mount - Huge Pages File System. Nov 12 17:40:20.603634 systemd[1]: Mounted dev-mqueue.mount - POSIX Message Queue File System. Nov 12 17:40:20.603673 systemd[1]: Mounted media.mount - External Media Directory. Nov 12 17:40:20.603710 systemd[1]: Mounted sys-kernel-debug.mount - Kernel Debug File System. Nov 12 17:40:20.603744 systemd[1]: Mounted sys-kernel-tracing.mount - Kernel Trace File System. Nov 12 17:40:20.603774 systemd[1]: Mounted tmp.mount - Temporary Directory /tmp. Nov 12 17:40:20.603807 systemd[1]: Finished kmod-static-nodes.service - Create List of Static Device Nodes. Nov 12 17:40:20.603839 systemd[1]: modprobe@configfs.service: Deactivated successfully. Nov 12 17:40:20.603882 systemd[1]: Finished modprobe@configfs.service - Load Kernel Module configfs. Nov 12 17:40:20.603915 systemd[1]: modprobe@dm_mod.service: Deactivated successfully. Nov 12 17:40:20.603950 systemd[1]: Finished modprobe@dm_mod.service - Load Kernel Module dm_mod. Nov 12 17:40:20.603986 systemd[1]: modprobe@drm.service: Deactivated successfully. Nov 12 17:40:20.604021 systemd[1]: Finished modprobe@drm.service - Load Kernel Module drm. Nov 12 17:40:20.604053 systemd[1]: modprobe@efi_pstore.service: Deactivated successfully. Nov 12 17:40:20.604088 systemd[1]: Finished modprobe@efi_pstore.service - Load Kernel Module efi_pstore. Nov 12 17:40:20.604121 systemd[1]: modprobe@fuse.service: Deactivated successfully. Nov 12 17:40:20.606327 systemd[1]: Finished modprobe@fuse.service - Load Kernel Module fuse. Nov 12 17:40:20.606385 systemd[1]: modprobe@loop.service: Deactivated successfully. Nov 12 17:40:20.606418 systemd[1]: Finished modprobe@loop.service - Load Kernel Module loop. Nov 12 17:40:20.606450 systemd[1]: Finished systemd-modules-load.service - Load Kernel Modules. Nov 12 17:40:20.606483 systemd[1]: Finished systemd-network-generator.service - Generate network units from Kernel command line. Nov 12 17:40:20.606514 systemd[1]: Finished systemd-remount-fs.service - Remount Root and Kernel File Systems. Nov 12 17:40:20.606554 systemd[1]: Reached target network-pre.target - Preparation for Network. Nov 12 17:40:20.606586 systemd[1]: Mounting sys-fs-fuse-connections.mount - FUSE Control File System... Nov 12 17:40:20.606617 systemd[1]: Mounting sys-kernel-config.mount - Kernel Configuration File System... Nov 12 17:40:20.606655 systemd[1]: remount-root.service - Remount Root File System was skipped because of an unmet condition check (ConditionPathIsReadWrite=!/). Nov 12 17:40:20.606688 systemd[1]: Reached target local-fs.target - Local File Systems. Nov 12 17:40:20.606721 systemd[1]: Listening on systemd-sysext.socket - System Extension Image Management (Varlink). Nov 12 17:40:20.606811 systemd-journald[1559]: Collecting audit messages is disabled. Nov 12 17:40:20.606873 systemd[1]: Starting dracut-shutdown.service - Restore /run/initramfs on shutdown... Nov 12 17:40:20.606908 systemd[1]: Starting ldconfig.service - Rebuild Dynamic Linker Cache... Nov 12 17:40:20.606943 systemd[1]: systemd-binfmt.service - Set Up Additional Binary Formats was skipped because no trigger condition checks were met. Nov 12 17:40:20.606974 systemd-journald[1559]: Journal started Nov 12 17:40:20.607032 systemd-journald[1559]: Runtime Journal (/run/log/journal/ec22bb7fc9328957bc837c83e4fb4b62) is 8.0M, max 75.3M, 67.3M free. Nov 12 17:40:19.789396 systemd[1]: Queued start job for default target multi-user.target. Nov 12 17:40:20.622742 systemd[1]: Starting systemd-hwdb-update.service - Rebuild Hardware Database... Nov 12 17:40:20.622833 systemd[1]: systemd-pstore.service - Platform Persistent Storage Archival was skipped because of an unmet condition check (ConditionDirectoryNotEmpty=/sys/fs/pstore). Nov 12 17:40:19.858112 systemd[1]: Unnecessary job was removed for dev-nvme0n1p6.device - /dev/nvme0n1p6. Nov 12 17:40:19.859030 systemd[1]: systemd-journald.service: Deactivated successfully. Nov 12 17:40:20.644262 systemd[1]: Starting systemd-random-seed.service - Load/Save OS Random Seed... Nov 12 17:40:20.655285 systemd[1]: systemd-repart.service - Repartition Root Disk was skipped because no trigger condition checks were met. Nov 12 17:40:20.655378 systemd[1]: Starting systemd-sysctl.service - Apply Kernel Variables... Nov 12 17:40:20.676463 systemd[1]: Starting systemd-sysext.service - Merge System Extension Images into /usr/ and /opt/... Nov 12 17:40:20.704225 systemd[1]: Starting systemd-tmpfiles-setup-dev-early.service - Create Static Device Nodes in /dev gracefully... Nov 12 17:40:20.704353 systemd[1]: Started systemd-journald.service - Journal Service. Nov 12 17:40:20.721790 systemd[1]: Finished flatcar-tmpfiles.service - Create missing system files. Nov 12 17:40:20.725069 systemd[1]: Mounted sys-fs-fuse-connections.mount - FUSE Control File System. Nov 12 17:40:20.729313 systemd[1]: Mounted sys-kernel-config.mount - Kernel Configuration File System. Nov 12 17:40:20.733511 systemd[1]: Finished dracut-shutdown.service - Restore /run/initramfs on shutdown. Nov 12 17:40:20.767368 systemd[1]: Finished systemd-random-seed.service - Load/Save OS Random Seed. Nov 12 17:40:20.791270 kernel: loop0: detected capacity change from 0 to 114432 Nov 12 17:40:20.817806 systemd[1]: Reached target first-boot-complete.target - First Boot Complete. Nov 12 17:40:20.831596 systemd[1]: Starting systemd-journal-flush.service - Flush Journal to Persistent Storage... Nov 12 17:40:20.842566 systemd[1]: Starting systemd-machine-id-commit.service - Commit a transient machine-id on disk... Nov 12 17:40:20.846158 systemd[1]: Finished systemd-sysctl.service - Apply Kernel Variables. Nov 12 17:40:20.912939 systemd[1]: etc-machine\x2did.mount: Deactivated successfully. Nov 12 17:40:20.924026 systemd[1]: Finished systemd-machine-id-commit.service - Commit a transient machine-id on disk. Nov 12 17:40:20.953642 kernel: squashfs: version 4.0 (2009/01/31) Phillip Lougher Nov 12 17:40:20.961316 systemd-journald[1559]: Time spent on flushing to /var/log/journal/ec22bb7fc9328957bc837c83e4fb4b62 is 107.696ms for 901 entries. Nov 12 17:40:20.961316 systemd-journald[1559]: System Journal (/var/log/journal/ec22bb7fc9328957bc837c83e4fb4b62) is 8.0M, max 195.6M, 187.6M free. Nov 12 17:40:21.087233 systemd-journald[1559]: Received client request to flush runtime journal. Nov 12 17:40:21.087348 kernel: loop1: detected capacity change from 0 to 114328 Nov 12 17:40:20.974827 systemd[1]: Finished systemd-udev-trigger.service - Coldplug All udev Devices. Nov 12 17:40:20.990500 systemd[1]: Starting systemd-udev-settle.service - Wait for udev To Complete Device Initialization... Nov 12 17:40:21.021748 systemd-tmpfiles[1596]: ACLs are not supported, ignoring. Nov 12 17:40:21.021776 systemd-tmpfiles[1596]: ACLs are not supported, ignoring. Nov 12 17:40:21.046967 systemd[1]: Finished systemd-tmpfiles-setup-dev-early.service - Create Static Device Nodes in /dev gracefully. Nov 12 17:40:21.065825 systemd[1]: Starting systemd-sysusers.service - Create System Users... Nov 12 17:40:21.078657 udevadm[1628]: systemd-udev-settle.service is deprecated. Please fix lvm2-activation-early.service, lvm2-activation.service not to pull it in. Nov 12 17:40:21.096871 systemd[1]: Finished systemd-journal-flush.service - Flush Journal to Persistent Storage. Nov 12 17:40:21.138228 kernel: loop2: detected capacity change from 0 to 52536 Nov 12 17:40:21.186242 systemd[1]: Finished systemd-sysusers.service - Create System Users. Nov 12 17:40:21.199506 systemd[1]: Starting systemd-tmpfiles-setup-dev.service - Create Static Device Nodes in /dev... Nov 12 17:40:21.278419 kernel: loop3: detected capacity change from 0 to 114432 Nov 12 17:40:21.285497 systemd-tmpfiles[1636]: ACLs are not supported, ignoring. Nov 12 17:40:21.286399 systemd-tmpfiles[1636]: ACLs are not supported, ignoring. Nov 12 17:40:21.300279 systemd[1]: Finished systemd-tmpfiles-setup-dev.service - Create Static Device Nodes in /dev. Nov 12 17:40:21.311005 kernel: loop4: detected capacity change from 0 to 114328 Nov 12 17:40:21.325197 kernel: loop5: detected capacity change from 0 to 52536 Nov 12 17:40:21.341239 (sd-merge)[1639]: Using extensions 'containerd-flatcar', 'docker-flatcar', 'oem-ami'. Nov 12 17:40:21.342962 (sd-merge)[1639]: Merged extensions into '/usr'. Nov 12 17:40:21.362386 systemd[1]: Finished systemd-sysext.service - Merge System Extension Images into /usr/ and /opt/. Nov 12 17:40:21.397642 systemd[1]: Starting ensure-sysext.service... Nov 12 17:40:21.412566 systemd[1]: Starting systemd-tmpfiles-setup.service - Create System Files and Directories... Nov 12 17:40:21.450829 systemd[1]: Reloading requested from client PID 1642 ('systemctl') (unit ensure-sysext.service)... Nov 12 17:40:21.450872 systemd[1]: Reloading... Nov 12 17:40:21.518411 systemd-tmpfiles[1643]: /usr/lib/tmpfiles.d/provision.conf:20: Duplicate line for path "/root", ignoring. Nov 12 17:40:21.521074 systemd-tmpfiles[1643]: /usr/lib/tmpfiles.d/systemd-flatcar.conf:6: Duplicate line for path "/var/log/journal", ignoring. Nov 12 17:40:21.526253 systemd-tmpfiles[1643]: /usr/lib/tmpfiles.d/systemd.conf:29: Duplicate line for path "/var/lib/systemd", ignoring. Nov 12 17:40:21.526993 systemd-tmpfiles[1643]: ACLs are not supported, ignoring. Nov 12 17:40:21.528580 systemd-tmpfiles[1643]: ACLs are not supported, ignoring. Nov 12 17:40:21.564094 systemd-tmpfiles[1643]: Detected autofs mount point /boot during canonicalization of boot. Nov 12 17:40:21.564126 systemd-tmpfiles[1643]: Skipping /boot Nov 12 17:40:21.637834 systemd-tmpfiles[1643]: Detected autofs mount point /boot during canonicalization of boot. Nov 12 17:40:21.637866 systemd-tmpfiles[1643]: Skipping /boot Nov 12 17:40:21.656315 zram_generator::config[1674]: No configuration found. Nov 12 17:40:22.070072 systemd[1]: /usr/lib/systemd/system/docker.socket:6: ListenStream= references a path below legacy directory /var/run/, updating /var/run/docker.sock → /run/docker.sock; please update the unit file accordingly. Nov 12 17:40:22.197983 systemd[1]: Reloading finished in 746 ms. Nov 12 17:40:22.250342 systemd[1]: Finished systemd-tmpfiles-setup.service - Create System Files and Directories. Nov 12 17:40:22.291668 systemd[1]: Starting audit-rules.service - Load Security Auditing Rules... Nov 12 17:40:22.307922 systemd[1]: Starting clean-ca-certificates.service - Clean up broken links in /etc/ssl/certs... Nov 12 17:40:22.326452 systemd[1]: Starting systemd-journal-catalog-update.service - Rebuild Journal Catalog... Nov 12 17:40:22.347186 systemd[1]: Starting systemd-resolved.service - Network Name Resolution... Nov 12 17:40:22.356696 systemd[1]: Starting systemd-update-utmp.service - Record System Boot/Shutdown in UTMP... Nov 12 17:40:22.372912 systemd[1]: ignition-delete-config.service - Ignition (delete config) was skipped because no trigger condition checks were met. Nov 12 17:40:22.391758 systemd[1]: Starting modprobe@dm_mod.service - Load Kernel Module dm_mod... Nov 12 17:40:22.401981 systemd[1]: Starting modprobe@efi_pstore.service - Load Kernel Module efi_pstore... Nov 12 17:40:22.413780 systemd[1]: Starting modprobe@loop.service - Load Kernel Module loop... Nov 12 17:40:22.416402 systemd[1]: systemd-binfmt.service - Set Up Additional Binary Formats was skipped because no trigger condition checks were met. Nov 12 17:40:22.424841 systemd[1]: ignition-delete-config.service - Ignition (delete config) was skipped because no trigger condition checks were met. Nov 12 17:40:22.425323 systemd[1]: systemd-binfmt.service - Set Up Additional Binary Formats was skipped because no trigger condition checks were met. Nov 12 17:40:22.435420 systemd[1]: ignition-delete-config.service - Ignition (delete config) was skipped because no trigger condition checks were met. Nov 12 17:40:22.439733 systemd[1]: Starting modprobe@drm.service - Load Kernel Module drm... Nov 12 17:40:22.444550 systemd[1]: systemd-binfmt.service - Set Up Additional Binary Formats was skipped because no trigger condition checks were met. Nov 12 17:40:22.445030 systemd[1]: Reached target time-set.target - System Time Set. Nov 12 17:40:22.453037 systemd[1]: Finished ensure-sysext.service. Nov 12 17:40:22.481853 systemd[1]: modprobe@loop.service: Deactivated successfully. Nov 12 17:40:22.486363 systemd[1]: Finished modprobe@loop.service - Load Kernel Module loop. Nov 12 17:40:22.490088 systemd[1]: modprobe@drm.service: Deactivated successfully. Nov 12 17:40:22.490469 systemd[1]: Finished modprobe@drm.service - Load Kernel Module drm. Nov 12 17:40:22.518175 systemd[1]: modprobe@efi_pstore.service: Deactivated successfully. Nov 12 17:40:22.518938 systemd[1]: Finished modprobe@efi_pstore.service - Load Kernel Module efi_pstore. Nov 12 17:40:22.532832 systemd[1]: modprobe@dm_mod.service: Deactivated successfully. Nov 12 17:40:22.536930 systemd[1]: Finished modprobe@dm_mod.service - Load Kernel Module dm_mod. Nov 12 17:40:22.540527 systemd[1]: systemd-pstore.service - Platform Persistent Storage Archival was skipped because of an unmet condition check (ConditionDirectoryNotEmpty=/sys/fs/pstore). Nov 12 17:40:22.540853 systemd[1]: systemd-repart.service - Repartition Root Disk was skipped because no trigger condition checks were met. Nov 12 17:40:22.553943 systemd[1]: Starting systemd-userdbd.service - User Database Manager... Nov 12 17:40:22.556974 systemd[1]: Finished systemd-update-utmp.service - Record System Boot/Shutdown in UTMP. Nov 12 17:40:22.596876 systemd[1]: Finished systemd-journal-catalog-update.service - Rebuild Journal Catalog. Nov 12 17:40:22.689846 augenrules[1756]: No rules Nov 12 17:40:22.695078 systemd[1]: Finished audit-rules.service - Load Security Auditing Rules. Nov 12 17:40:22.711033 systemd[1]: Started systemd-userdbd.service - User Database Manager. Nov 12 17:40:22.716323 systemd[1]: Finished systemd-hwdb-update.service - Rebuild Hardware Database. Nov 12 17:40:22.734511 systemd[1]: Starting systemd-udevd.service - Rule-based Manager for Device Events and Files... Nov 12 17:40:22.834960 systemd-udevd[1767]: Using default interface naming scheme 'v255'. Nov 12 17:40:22.860019 systemd[1]: Finished clean-ca-certificates.service - Clean up broken links in /etc/ssl/certs. Nov 12 17:40:22.863924 systemd[1]: update-ca-certificates.service - Update CA bundle at /etc/ssl/certs/ca-certificates.crt was skipped because of an unmet condition check (ConditionPathIsSymbolicLink=!/etc/ssl/certs/ca-certificates.crt). Nov 12 17:40:22.888361 systemd[1]: Started systemd-udevd.service - Rule-based Manager for Device Events and Files. Nov 12 17:40:22.909083 systemd[1]: Starting systemd-networkd.service - Network Configuration... Nov 12 17:40:22.979987 ldconfig[1588]: /sbin/ldconfig: /lib/ld.so.conf is not an ELF file - it has the wrong magic bytes at the start. Nov 12 17:40:22.998284 systemd[1]: Finished ldconfig.service - Rebuild Dynamic Linker Cache. Nov 12 17:40:23.002800 systemd-resolved[1728]: Positive Trust Anchors: Nov 12 17:40:23.002842 systemd-resolved[1728]: . IN DS 20326 8 2 e06d44b80b8f1d39a95c0b0d7c65d08458e880409bbc683457104237c7f8ec8d Nov 12 17:40:23.002908 systemd-resolved[1728]: Negative trust anchors: home.arpa 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 170.0.0.192.in-addr.arpa 171.0.0.192.in-addr.arpa 168.192.in-addr.arpa d.f.ip6.arpa ipv4only.arpa resolver.arpa corp home internal intranet lan local private test Nov 12 17:40:23.028530 systemd[1]: Starting systemd-update-done.service - Update is Completed... Nov 12 17:40:23.033994 systemd-resolved[1728]: Defaulting to hostname 'linux'. Nov 12 17:40:23.041869 systemd[1]: Started systemd-resolved.service - Network Name Resolution. Nov 12 17:40:23.044641 systemd[1]: Reached target nss-lookup.target - Host and Network Name Lookups. Nov 12 17:40:23.092346 systemd[1]: Finished systemd-update-done.service - Update is Completed. Nov 12 17:40:23.115437 systemd-networkd[1772]: lo: Link UP Nov 12 17:40:23.116116 systemd-networkd[1772]: lo: Gained carrier Nov 12 17:40:23.118226 systemd-networkd[1772]: Enumeration completed Nov 12 17:40:23.118930 systemd[1]: Started systemd-networkd.service - Network Configuration. Nov 12 17:40:23.124465 systemd[1]: Reached target network.target - Network. Nov 12 17:40:23.157675 systemd[1]: Starting systemd-networkd-wait-online.service - Wait for Network to be Configured... Nov 12 17:40:23.244225 kernel: BTRFS info: devid 1 device path /dev/mapper/usr changed to /dev/dm-0 scanned by (udev-worker) (1784) Nov 12 17:40:23.249923 (udev-worker)[1778]: Network interface NamePolicy= disabled on kernel command line. Nov 12 17:40:23.252062 systemd[1]: Condition check resulted in dev-ttyS0.device - /dev/ttyS0 being skipped. Nov 12 17:40:23.271235 kernel: BTRFS info: devid 1 device path /dev/dm-0 changed to /dev/mapper/usr scanned by (udev-worker) (1784) Nov 12 17:40:23.366750 systemd-networkd[1772]: eth0: found matching network '/usr/lib/systemd/network/zz-default.network', based on potentially unpredictable interface name. Nov 12 17:40:23.367018 systemd-networkd[1772]: eth0: Configuring with /usr/lib/systemd/network/zz-default.network. Nov 12 17:40:23.371438 systemd-networkd[1772]: eth0: Link UP Nov 12 17:40:23.372367 systemd-networkd[1772]: eth0: Gained carrier Nov 12 17:40:23.373073 systemd-networkd[1772]: eth0: found matching network '/usr/lib/systemd/network/zz-default.network', based on potentially unpredictable interface name. Nov 12 17:40:23.384305 systemd-networkd[1772]: eth0: DHCPv4 address 172.31.30.96/20, gateway 172.31.16.1 acquired from 172.31.16.1 Nov 12 17:40:23.471197 kernel: BTRFS warning: duplicate device /dev/nvme0n1p3 devid 1 generation 40 scanned by (udev-worker) (1793) Nov 12 17:40:23.605368 systemd[1]: Starting systemd-vconsole-setup.service - Virtual Console Setup... Nov 12 17:40:23.755297 systemd[1]: Found device dev-disk-by\x2dlabel-OEM.device - Amazon Elastic Block Store OEM. Nov 12 17:40:23.771572 systemd[1]: Starting systemd-fsck@dev-disk-by\x2dlabel-OEM.service - File System Check on /dev/disk/by-label/OEM... Nov 12 17:40:23.780273 systemd[1]: Finished systemd-udev-settle.service - Wait for udev To Complete Device Initialization. Nov 12 17:40:23.784531 systemd[1]: Finished systemd-vconsole-setup.service - Virtual Console Setup. Nov 12 17:40:23.797650 systemd[1]: Starting lvm2-activation-early.service - Activation of LVM2 logical volumes... Nov 12 17:40:23.830231 lvm[1897]: WARNING: Failed to connect to lvmetad. Falling back to device scanning. Nov 12 17:40:23.837273 systemd[1]: Finished systemd-fsck@dev-disk-by\x2dlabel-OEM.service - File System Check on /dev/disk/by-label/OEM. Nov 12 17:40:23.879128 systemd[1]: Finished lvm2-activation-early.service - Activation of LVM2 logical volumes. Nov 12 17:40:23.882298 systemd[1]: Reached target cryptsetup.target - Local Encrypted Volumes. Nov 12 17:40:23.884561 systemd[1]: Reached target sysinit.target - System Initialization. Nov 12 17:40:23.887068 systemd[1]: Started motdgen.path - Watch for update engine configuration changes. Nov 12 17:40:23.889975 systemd[1]: Started user-cloudinit@var-lib-flatcar\x2dinstall-user_data.path - Watch for a cloud-config at /var/lib/flatcar-install/user_data. Nov 12 17:40:23.893374 systemd[1]: Started logrotate.timer - Daily rotation of log files. Nov 12 17:40:23.895837 systemd[1]: Started mdadm.timer - Weekly check for MD array's redundancy information.. Nov 12 17:40:23.898482 systemd[1]: Started systemd-tmpfiles-clean.timer - Daily Cleanup of Temporary Directories. Nov 12 17:40:23.900991 systemd[1]: update-engine-stub.timer - Update Engine Stub Timer was skipped because of an unmet condition check (ConditionPathExists=/usr/.noupdate). Nov 12 17:40:23.901277 systemd[1]: Reached target paths.target - Path Units. Nov 12 17:40:23.903317 systemd[1]: Reached target timers.target - Timer Units. Nov 12 17:40:23.921596 systemd[1]: Listening on dbus.socket - D-Bus System Message Bus Socket. Nov 12 17:40:23.928574 systemd[1]: Starting docker.socket - Docker Socket for the API... Nov 12 17:40:23.948216 systemd[1]: Listening on sshd.socket - OpenSSH Server Socket. Nov 12 17:40:23.960758 systemd[1]: Starting lvm2-activation.service - Activation of LVM2 logical volumes... Nov 12 17:40:23.965303 systemd[1]: Listening on docker.socket - Docker Socket for the API. Nov 12 17:40:23.968926 systemd[1]: Reached target sockets.target - Socket Units. Nov 12 17:40:23.971448 systemd[1]: Reached target basic.target - Basic System. Nov 12 17:40:23.973744 systemd[1]: addon-config@oem.service - Configure Addon /oem was skipped because no trigger condition checks were met. Nov 12 17:40:23.973807 systemd[1]: addon-run@oem.service - Run Addon /oem was skipped because no trigger condition checks were met. Nov 12 17:40:23.983443 systemd[1]: Starting containerd.service - containerd container runtime... Nov 12 17:40:23.990556 lvm[1903]: WARNING: Failed to connect to lvmetad. Falling back to device scanning. Nov 12 17:40:23.998572 systemd[1]: Starting coreos-metadata.service - Flatcar Metadata Agent... Nov 12 17:40:24.007822 systemd[1]: Starting dbus.service - D-Bus System Message Bus... Nov 12 17:40:24.015493 systemd[1]: Starting enable-oem-cloudinit.service - Enable cloudinit... Nov 12 17:40:24.031897 systemd[1]: Starting extend-filesystems.service - Extend Filesystems... Nov 12 17:40:24.034310 systemd[1]: flatcar-setup-environment.service - Modifies /etc/environment for CoreOS was skipped because of an unmet condition check (ConditionPathExists=/oem/bin/flatcar-setup-environment). Nov 12 17:40:24.040404 systemd[1]: Starting motdgen.service - Generate /run/flatcar/motd... Nov 12 17:40:24.056744 systemd[1]: Started ntpd.service - Network Time Service. Nov 12 17:40:24.069690 systemd[1]: Starting setup-oem.service - Setup OEM... Nov 12 17:40:24.077456 systemd[1]: Starting ssh-key-proc-cmdline.service - Install an ssh key from /proc/cmdline... Nov 12 17:40:24.093823 systemd[1]: Starting sshd-keygen.service - Generate sshd host keys... Nov 12 17:40:24.117609 systemd[1]: Starting systemd-logind.service - User Login Management... Nov 12 17:40:24.121695 systemd[1]: tcsd.service - TCG Core Services Daemon was skipped because of an unmet condition check (ConditionPathExists=/dev/tpm0). Nov 12 17:40:24.122950 systemd[1]: cgroup compatibility translation between legacy and unified hierarchy settings activated. See cgroup-compat debug messages for details. Nov 12 17:40:24.128351 systemd[1]: Starting update-engine.service - Update Engine... Nov 12 17:40:24.134408 systemd[1]: Starting update-ssh-keys-after-ignition.service - Run update-ssh-keys once after Ignition... Nov 12 17:40:24.141317 systemd[1]: Finished lvm2-activation.service - Activation of LVM2 logical volumes. Nov 12 17:40:24.194885 systemd[1]: Created slice system-sshd.slice - Slice /system/sshd. Nov 12 17:40:24.207803 extend-filesystems[1908]: Found loop3 Nov 12 17:40:24.207803 extend-filesystems[1908]: Found loop4 Nov 12 17:40:24.207803 extend-filesystems[1908]: Found loop5 Nov 12 17:40:24.207803 extend-filesystems[1908]: Found nvme0n1 Nov 12 17:40:24.207803 extend-filesystems[1908]: Found nvme0n1p1 Nov 12 17:40:24.207803 extend-filesystems[1908]: Found nvme0n1p2 Nov 12 17:40:24.207803 extend-filesystems[1908]: Found nvme0n1p3 Nov 12 17:40:24.207803 extend-filesystems[1908]: Found usr Nov 12 17:40:24.207803 extend-filesystems[1908]: Found nvme0n1p4 Nov 12 17:40:24.207803 extend-filesystems[1908]: Found nvme0n1p6 Nov 12 17:40:24.207803 extend-filesystems[1908]: Found nvme0n1p7 Nov 12 17:40:24.207803 extend-filesystems[1908]: Found nvme0n1p9 Nov 12 17:40:24.207803 extend-filesystems[1908]: Checking size of /dev/nvme0n1p9 Nov 12 17:40:24.289407 jq[1907]: false Nov 12 17:40:24.257680 systemd[1]: enable-oem-cloudinit.service: Skipped due to 'exec-condition'. Nov 12 17:40:24.259678 systemd[1]: Condition check resulted in enable-oem-cloudinit.service - Enable cloudinit being skipped. Nov 12 17:40:24.266394 systemd[1]: ssh-key-proc-cmdline.service: Deactivated successfully. Nov 12 17:40:24.293740 jq[1919]: true Nov 12 17:40:24.270106 systemd[1]: Finished ssh-key-proc-cmdline.service - Install an ssh key from /proc/cmdline. Nov 12 17:40:24.304847 ntpd[1910]: ntpd 4.2.8p17@1.4004-o Tue Nov 12 15:49:27 UTC 2024 (1): Starting Nov 12 17:40:24.335501 ntpd[1910]: 12 Nov 17:40:24 ntpd[1910]: ntpd 4.2.8p17@1.4004-o Tue Nov 12 15:49:27 UTC 2024 (1): Starting Nov 12 17:40:24.335501 ntpd[1910]: 12 Nov 17:40:24 ntpd[1910]: Command line: /usr/sbin/ntpd -g -n -u ntp:ntp Nov 12 17:40:24.335501 ntpd[1910]: 12 Nov 17:40:24 ntpd[1910]: ---------------------------------------------------- Nov 12 17:40:24.335501 ntpd[1910]: 12 Nov 17:40:24 ntpd[1910]: ntp-4 is maintained by Network Time Foundation, Nov 12 17:40:24.335501 ntpd[1910]: 12 Nov 17:40:24 ntpd[1910]: Inc. (NTF), a non-profit 501(c)(3) public-benefit Nov 12 17:40:24.335501 ntpd[1910]: 12 Nov 17:40:24 ntpd[1910]: corporation. Support and training for ntp-4 are Nov 12 17:40:24.335501 ntpd[1910]: 12 Nov 17:40:24 ntpd[1910]: available at https://www.nwtime.org/support Nov 12 17:40:24.335501 ntpd[1910]: 12 Nov 17:40:24 ntpd[1910]: ---------------------------------------------------- Nov 12 17:40:24.335501 ntpd[1910]: 12 Nov 17:40:24 ntpd[1910]: proto: precision = 0.108 usec (-23) Nov 12 17:40:24.335501 ntpd[1910]: 12 Nov 17:40:24 ntpd[1910]: basedate set to 2024-10-31 Nov 12 17:40:24.335501 ntpd[1910]: 12 Nov 17:40:24 ntpd[1910]: gps base set to 2024-11-03 (week 2339) Nov 12 17:40:24.304948 ntpd[1910]: Command line: /usr/sbin/ntpd -g -n -u ntp:ntp Nov 12 17:40:24.304977 ntpd[1910]: ---------------------------------------------------- Nov 12 17:40:24.304999 ntpd[1910]: ntp-4 is maintained by Network Time Foundation, Nov 12 17:40:24.305021 ntpd[1910]: Inc. (NTF), a non-profit 501(c)(3) public-benefit Nov 12 17:40:24.305044 ntpd[1910]: corporation. Support and training for ntp-4 are Nov 12 17:40:24.305064 ntpd[1910]: available at https://www.nwtime.org/support Nov 12 17:40:24.305084 ntpd[1910]: ---------------------------------------------------- Nov 12 17:40:24.317997 ntpd[1910]: proto: precision = 0.108 usec (-23) Nov 12 17:40:24.323009 ntpd[1910]: basedate set to 2024-10-31 Nov 12 17:40:24.323057 ntpd[1910]: gps base set to 2024-11-03 (week 2339) Nov 12 17:40:24.356420 ntpd[1910]: Listen and drop on 0 v6wildcard [::]:123 Nov 12 17:40:24.360944 ntpd[1910]: 12 Nov 17:40:24 ntpd[1910]: Listen and drop on 0 v6wildcard [::]:123 Nov 12 17:40:24.360944 ntpd[1910]: 12 Nov 17:40:24 ntpd[1910]: Listen and drop on 1 v4wildcard 0.0.0.0:123 Nov 12 17:40:24.360944 ntpd[1910]: 12 Nov 17:40:24 ntpd[1910]: Listen normally on 2 lo 127.0.0.1:123 Nov 12 17:40:24.360944 ntpd[1910]: 12 Nov 17:40:24 ntpd[1910]: Listen normally on 3 eth0 172.31.30.96:123 Nov 12 17:40:24.360944 ntpd[1910]: 12 Nov 17:40:24 ntpd[1910]: Listen normally on 4 lo [::1]:123 Nov 12 17:40:24.360944 ntpd[1910]: 12 Nov 17:40:24 ntpd[1910]: bind(21) AF_INET6 fe80::44c:dbff:fe4d:ebf1%2#123 flags 0x11 failed: Cannot assign requested address Nov 12 17:40:24.360944 ntpd[1910]: 12 Nov 17:40:24 ntpd[1910]: unable to create socket on eth0 (5) for fe80::44c:dbff:fe4d:ebf1%2#123 Nov 12 17:40:24.360944 ntpd[1910]: 12 Nov 17:40:24 ntpd[1910]: failed to init interface for address fe80::44c:dbff:fe4d:ebf1%2 Nov 12 17:40:24.360944 ntpd[1910]: 12 Nov 17:40:24 ntpd[1910]: Listening on routing socket on fd #21 for interface updates Nov 12 17:40:24.356569 ntpd[1910]: Listen and drop on 1 v4wildcard 0.0.0.0:123 Nov 12 17:40:24.357011 ntpd[1910]: Listen normally on 2 lo 127.0.0.1:123 Nov 12 17:40:24.357127 ntpd[1910]: Listen normally on 3 eth0 172.31.30.96:123 Nov 12 17:40:24.357283 ntpd[1910]: Listen normally on 4 lo [::1]:123 Nov 12 17:40:24.357412 ntpd[1910]: bind(21) AF_INET6 fe80::44c:dbff:fe4d:ebf1%2#123 flags 0x11 failed: Cannot assign requested address Nov 12 17:40:24.357456 ntpd[1910]: unable to create socket on eth0 (5) for fe80::44c:dbff:fe4d:ebf1%2#123 Nov 12 17:40:24.357484 ntpd[1910]: failed to init interface for address fe80::44c:dbff:fe4d:ebf1%2 Nov 12 17:40:24.357547 ntpd[1910]: Listening on routing socket on fd #21 for interface updates Nov 12 17:40:24.394360 extend-filesystems[1908]: Resized partition /dev/nvme0n1p9 Nov 12 17:40:24.365801 dbus-daemon[1906]: [system] SELinux support is enabled Nov 12 17:40:24.366307 systemd[1]: Started dbus.service - D-Bus System Message Bus. Nov 12 17:40:24.373781 systemd[1]: system-cloudinit@usr-share-oem-cloud\x2dconfig.yml.service - Load cloud-config from /usr/share/oem/cloud-config.yml was skipped because of an unmet condition check (ConditionFileNotEmpty=/usr/share/oem/cloud-config.yml). Nov 12 17:40:24.373839 systemd[1]: Reached target system-config.target - Load system-provided cloud configs. Nov 12 17:40:24.390723 systemd[1]: user-cloudinit-proc-cmdline.service - Load cloud-config from url defined in /proc/cmdline was skipped because of an unmet condition check (ConditionKernelCommandLine=cloud-config-url). Nov 12 17:40:24.390789 systemd[1]: Reached target user-config.target - Load user-provided cloud configs. Nov 12 17:40:24.408370 dbus-daemon[1906]: [system] Activating via systemd: service name='org.freedesktop.hostname1' unit='dbus-org.freedesktop.hostname1.service' requested by ':1.2' (uid=244 pid=1772 comm="/usr/lib/systemd/systemd-networkd" label="system_u:system_r:kernel_t:s0") Nov 12 17:40:24.421519 ntpd[1910]: 12 Nov 17:40:24 ntpd[1910]: kernel reports TIME_ERROR: 0x41: Clock Unsynchronized Nov 12 17:40:24.421519 ntpd[1910]: 12 Nov 17:40:24 ntpd[1910]: kernel reports TIME_ERROR: 0x41: Clock Unsynchronized Nov 12 17:40:24.421628 extend-filesystems[1948]: resize2fs 1.47.1 (20-May-2024) Nov 12 17:40:24.434867 kernel: EXT4-fs (nvme0n1p9): resizing filesystem from 553472 to 1489915 blocks Nov 12 17:40:24.434927 jq[1928]: true Nov 12 17:40:24.418003 ntpd[1910]: kernel reports TIME_ERROR: 0x41: Clock Unsynchronized Nov 12 17:40:24.448030 update_engine[1918]: I20241112 17:40:24.433717 1918 main.cc:92] Flatcar Update Engine starting Nov 12 17:40:24.435459 systemd[1]: Starting systemd-hostnamed.service - Hostname Service... Nov 12 17:40:24.418098 ntpd[1910]: kernel reports TIME_ERROR: 0x41: Clock Unsynchronized Nov 12 17:40:24.436651 (ntainerd)[1940]: containerd.service: Referenced but unset environment variable evaluates to an empty string: TORCX_IMAGEDIR, TORCX_UNPACKDIR Nov 12 17:40:24.459830 systemd[1]: Started update-engine.service - Update Engine. Nov 12 17:40:24.475714 update_engine[1918]: I20241112 17:40:24.466601 1918 update_check_scheduler.cc:74] Next update check in 3m51s Nov 12 17:40:24.468444 systemd[1]: Started locksmithd.service - Cluster reboot manager. Nov 12 17:40:24.474533 systemd[1]: motdgen.service: Deactivated successfully. Nov 12 17:40:24.476285 systemd[1]: Finished motdgen.service - Generate /run/flatcar/motd. Nov 12 17:40:24.523248 kernel: EXT4-fs (nvme0n1p9): resized filesystem to 1489915 Nov 12 17:40:24.582192 extend-filesystems[1948]: Filesystem at /dev/nvme0n1p9 is mounted on /; on-line resizing required Nov 12 17:40:24.582192 extend-filesystems[1948]: old_desc_blocks = 1, new_desc_blocks = 1 Nov 12 17:40:24.582192 extend-filesystems[1948]: The filesystem on /dev/nvme0n1p9 is now 1489915 (4k) blocks long. Nov 12 17:40:24.594674 extend-filesystems[1908]: Resized filesystem in /dev/nvme0n1p9 Nov 12 17:40:24.603972 systemd[1]: extend-filesystems.service: Deactivated successfully. Nov 12 17:40:24.604441 systemd[1]: Finished extend-filesystems.service - Extend Filesystems. Nov 12 17:40:24.623235 kernel: BTRFS warning: duplicate device /dev/nvme0n1p3 devid 1 generation 40 scanned by (udev-worker) (1776) Nov 12 17:40:24.794181 coreos-metadata[1905]: Nov 12 17:40:24.793 INFO Putting http://169.254.169.254/latest/api/token: Attempt #1 Nov 12 17:40:24.837577 bash[2004]: Updated "/home/core/.ssh/authorized_keys" Nov 12 17:40:24.837866 coreos-metadata[1905]: Nov 12 17:40:24.796 INFO Fetching http://169.254.169.254/2021-01-03/meta-data/instance-id: Attempt #1 Nov 12 17:40:24.837866 coreos-metadata[1905]: Nov 12 17:40:24.796 INFO Fetch successful Nov 12 17:40:24.837866 coreos-metadata[1905]: Nov 12 17:40:24.796 INFO Fetching http://169.254.169.254/2021-01-03/meta-data/instance-type: Attempt #1 Nov 12 17:40:24.837866 coreos-metadata[1905]: Nov 12 17:40:24.799 INFO Fetch successful Nov 12 17:40:24.837866 coreos-metadata[1905]: Nov 12 17:40:24.799 INFO Fetching http://169.254.169.254/2021-01-03/meta-data/local-ipv4: Attempt #1 Nov 12 17:40:24.837866 coreos-metadata[1905]: Nov 12 17:40:24.799 INFO Fetch successful Nov 12 17:40:24.837866 coreos-metadata[1905]: Nov 12 17:40:24.800 INFO Fetching http://169.254.169.254/2021-01-03/meta-data/public-ipv4: Attempt #1 Nov 12 17:40:24.837866 coreos-metadata[1905]: Nov 12 17:40:24.801 INFO Fetch successful Nov 12 17:40:24.837866 coreos-metadata[1905]: Nov 12 17:40:24.801 INFO Fetching http://169.254.169.254/2021-01-03/meta-data/ipv6: Attempt #1 Nov 12 17:40:24.837866 coreos-metadata[1905]: Nov 12 17:40:24.807 INFO Fetch failed with 404: resource not found Nov 12 17:40:24.837866 coreos-metadata[1905]: Nov 12 17:40:24.807 INFO Fetching http://169.254.169.254/2021-01-03/meta-data/placement/availability-zone: Attempt #1 Nov 12 17:40:24.837866 coreos-metadata[1905]: Nov 12 17:40:24.807 INFO Fetch successful Nov 12 17:40:24.837866 coreos-metadata[1905]: Nov 12 17:40:24.807 INFO Fetching http://169.254.169.254/2021-01-03/meta-data/placement/availability-zone-id: Attempt #1 Nov 12 17:40:24.837866 coreos-metadata[1905]: Nov 12 17:40:24.807 INFO Fetch successful Nov 12 17:40:24.837866 coreos-metadata[1905]: Nov 12 17:40:24.807 INFO Fetching http://169.254.169.254/2021-01-03/meta-data/hostname: Attempt #1 Nov 12 17:40:24.837866 coreos-metadata[1905]: Nov 12 17:40:24.811 INFO Fetch successful Nov 12 17:40:24.837866 coreos-metadata[1905]: Nov 12 17:40:24.811 INFO Fetching http://169.254.169.254/2021-01-03/meta-data/public-hostname: Attempt #1 Nov 12 17:40:24.837866 coreos-metadata[1905]: Nov 12 17:40:24.812 INFO Fetch successful Nov 12 17:40:24.837866 coreos-metadata[1905]: Nov 12 17:40:24.812 INFO Fetching http://169.254.169.254/2021-01-03/dynamic/instance-identity/document: Attempt #1 Nov 12 17:40:24.837866 coreos-metadata[1905]: Nov 12 17:40:24.813 INFO Fetch successful Nov 12 17:40:24.899303 systemd[1]: Finished update-ssh-keys-after-ignition.service - Run update-ssh-keys once after Ignition. Nov 12 17:40:24.904021 systemd[1]: Finished setup-oem.service - Setup OEM. Nov 12 17:40:24.915597 systemd-logind[1916]: Watching system buttons on /dev/input/event0 (Power Button) Nov 12 17:40:24.915646 systemd-logind[1916]: Watching system buttons on /dev/input/event1 (Sleep Button) Nov 12 17:40:24.916909 systemd-logind[1916]: New seat seat0. Nov 12 17:40:24.995461 systemd-networkd[1772]: eth0: Gained IPv6LL Nov 12 17:40:25.044947 systemd[1]: Starting sshkeys.service... Nov 12 17:40:25.046890 systemd[1]: Started systemd-logind.service - User Login Management. Nov 12 17:40:25.068791 systemd[1]: Finished systemd-networkd-wait-online.service - Wait for Network to be Configured. Nov 12 17:40:25.076767 systemd[1]: Reached target network-online.target - Network is Online. Nov 12 17:40:25.089970 systemd[1]: Started amazon-ssm-agent.service - amazon-ssm-agent. Nov 12 17:40:25.095714 systemd[1]: Starting nvidia.service - NVIDIA Configure Service... Nov 12 17:40:25.107376 locksmithd[1954]: locksmithd starting currentOperation="UPDATE_STATUS_IDLE" strategy="reboot" Nov 12 17:40:25.156026 systemd[1]: Created slice system-coreos\x2dmetadata\x2dsshkeys.slice - Slice /system/coreos-metadata-sshkeys. Nov 12 17:40:25.167025 systemd[1]: Starting coreos-metadata-sshkeys@core.service - Flatcar Metadata Agent (SSH Keys)... Nov 12 17:40:25.170452 systemd[1]: Finished coreos-metadata.service - Flatcar Metadata Agent. Nov 12 17:40:25.195682 systemd[1]: Starting etcd-member.service - etcd (System Application Container)... Nov 12 17:40:25.198323 systemd[1]: packet-phone-home.service - Report Success to Packet was skipped because no trigger condition checks were met. Nov 12 17:40:25.212908 (-wrapper)[2070]: etcd-member.service: Referenced but unset environment variable evaluates to an empty string: ETCD_OPTS Nov 12 17:40:25.375988 dbus-daemon[1906]: [system] Successfully activated service 'org.freedesktop.hostname1' Nov 12 17:40:25.380864 systemd[1]: Finished nvidia.service - NVIDIA Configure Service. Nov 12 17:40:25.384774 systemd[1]: Started systemd-hostnamed.service - Hostname Service. Nov 12 17:40:25.404205 dbus-daemon[1906]: [system] Activating via systemd: service name='org.freedesktop.PolicyKit1' unit='polkit.service' requested by ':1.7' (uid=0 pid=1950 comm="/usr/lib/systemd/systemd-hostnamed" label="system_u:system_r:kernel_t:s0") Nov 12 17:40:25.417058 systemd[1]: Starting polkit.service - Authorization Manager... Nov 12 17:40:25.569450 polkitd[2102]: Started polkitd version 121 Nov 12 17:40:25.614535 amazon-ssm-agent[2061]: Initializing new seelog logger Nov 12 17:40:25.617427 amazon-ssm-agent[2061]: New Seelog Logger Creation Complete Nov 12 17:40:25.617427 amazon-ssm-agent[2061]: 2024/11/12 17:40:25 Found config file at /etc/amazon/ssm/amazon-ssm-agent.json. Nov 12 17:40:25.617427 amazon-ssm-agent[2061]: Applying config override from /etc/amazon/ssm/amazon-ssm-agent.json. Nov 12 17:40:25.621464 coreos-metadata[2068]: Nov 12 17:40:25.618 INFO Putting http://169.254.169.254/latest/api/token: Attempt #1 Nov 12 17:40:25.621464 coreos-metadata[2068]: Nov 12 17:40:25.618 INFO Fetching http://169.254.169.254/2021-01-03/meta-data/public-keys: Attempt #1 Nov 12 17:40:25.621464 coreos-metadata[2068]: Nov 12 17:40:25.618 INFO Fetch successful Nov 12 17:40:25.621464 coreos-metadata[2068]: Nov 12 17:40:25.618 INFO Fetching http://169.254.169.254/2021-01-03/meta-data/public-keys/0/openssh-key: Attempt #1 Nov 12 17:40:25.621464 coreos-metadata[2068]: Nov 12 17:40:25.618 INFO Fetch successful Nov 12 17:40:25.622193 amazon-ssm-agent[2061]: 2024/11/12 17:40:25 processing appconfig overrides Nov 12 17:40:25.622193 amazon-ssm-agent[2061]: 2024/11/12 17:40:25 Found config file at /etc/amazon/ssm/amazon-ssm-agent.json. Nov 12 17:40:25.622193 amazon-ssm-agent[2061]: Applying config override from /etc/amazon/ssm/amazon-ssm-agent.json. Nov 12 17:40:25.622193 amazon-ssm-agent[2061]: 2024/11/12 17:40:25 processing appconfig overrides Nov 12 17:40:25.622193 amazon-ssm-agent[2061]: 2024/11/12 17:40:25 Found config file at /etc/amazon/ssm/amazon-ssm-agent.json. Nov 12 17:40:25.622193 amazon-ssm-agent[2061]: Applying config override from /etc/amazon/ssm/amazon-ssm-agent.json. Nov 12 17:40:25.622193 amazon-ssm-agent[2061]: 2024/11/12 17:40:25 processing appconfig overrides Nov 12 17:40:25.624305 amazon-ssm-agent[2061]: 2024-11-12 17:40:25 INFO Proxy environment variables: Nov 12 17:40:25.628884 amazon-ssm-agent[2061]: 2024/11/12 17:40:25 Found config file at /etc/amazon/ssm/amazon-ssm-agent.json. Nov 12 17:40:25.628884 amazon-ssm-agent[2061]: Applying config override from /etc/amazon/ssm/amazon-ssm-agent.json. Nov 12 17:40:25.631575 amazon-ssm-agent[2061]: 2024/11/12 17:40:25 processing appconfig overrides Nov 12 17:40:25.640101 polkitd[2102]: Loading rules from directory /etc/polkit-1/rules.d Nov 12 17:40:25.644096 unknown[2068]: wrote ssh authorized keys file for user: core Nov 12 17:40:25.642666 polkitd[2102]: Loading rules from directory /usr/share/polkit-1/rules.d Nov 12 17:40:25.645416 polkitd[2102]: Finished loading, compiling and executing 2 rules Nov 12 17:40:25.649540 dbus-daemon[1906]: [system] Successfully activated service 'org.freedesktop.PolicyKit1' Nov 12 17:40:25.652497 systemd[1]: Started polkit.service - Authorization Manager. Nov 12 17:40:25.658520 polkitd[2102]: Acquired the name org.freedesktop.PolicyKit1 on the system bus Nov 12 17:40:25.682789 containerd[1940]: time="2024-11-12T17:40:25.682604964Z" level=info msg="starting containerd" revision=174e0d1785eeda18dc2beba45e1d5a188771636b version=v1.7.21 Nov 12 17:40:25.724116 amazon-ssm-agent[2061]: 2024-11-12 17:40:25 INFO https_proxy: Nov 12 17:40:25.732299 systemd-hostnamed[1950]: Hostname set to (transient) Nov 12 17:40:25.733483 systemd-resolved[1728]: System hostname changed to 'ip-172-31-30-96'. Nov 12 17:40:25.755175 update-ssh-keys[2125]: Updated "/home/core/.ssh/authorized_keys" Nov 12 17:40:25.763255 systemd[1]: Finished coreos-metadata-sshkeys@core.service - Flatcar Metadata Agent (SSH Keys). Nov 12 17:40:25.776685 systemd[1]: Finished sshkeys.service. Nov 12 17:40:25.779283 containerd[1940]: time="2024-11-12T17:40:25.779123640Z" level=info msg="loading plugin \"io.containerd.snapshotter.v1.aufs\"..." type=io.containerd.snapshotter.v1 Nov 12 17:40:25.790241 containerd[1940]: time="2024-11-12T17:40:25.789820836Z" level=info msg="skip loading plugin \"io.containerd.snapshotter.v1.aufs\"..." error="aufs is not supported (modprobe aufs failed: exit status 1 \"modprobe: FATAL: Module aufs not found in directory /lib/modules/6.6.60-flatcar\\n\"): skip plugin" type=io.containerd.snapshotter.v1 Nov 12 17:40:25.790241 containerd[1940]: time="2024-11-12T17:40:25.790008624Z" level=info msg="loading plugin \"io.containerd.event.v1.exchange\"..." type=io.containerd.event.v1 Nov 12 17:40:25.790241 containerd[1940]: time="2024-11-12T17:40:25.790105500Z" level=info msg="loading plugin \"io.containerd.internal.v1.opt\"..." type=io.containerd.internal.v1 Nov 12 17:40:25.795203 containerd[1940]: time="2024-11-12T17:40:25.794716092Z" level=info msg="loading plugin \"io.containerd.warning.v1.deprecations\"..." type=io.containerd.warning.v1 Nov 12 17:40:25.795203 containerd[1940]: time="2024-11-12T17:40:25.794826612Z" level=info msg="loading plugin \"io.containerd.snapshotter.v1.blockfile\"..." type=io.containerd.snapshotter.v1 Nov 12 17:40:25.795203 containerd[1940]: time="2024-11-12T17:40:25.794997192Z" level=info msg="skip loading plugin \"io.containerd.snapshotter.v1.blockfile\"..." error="no scratch file generator: skip plugin" type=io.containerd.snapshotter.v1 Nov 12 17:40:25.795203 containerd[1940]: time="2024-11-12T17:40:25.795042588Z" level=info msg="loading plugin \"io.containerd.snapshotter.v1.btrfs\"..." type=io.containerd.snapshotter.v1 Nov 12 17:40:25.795812 containerd[1940]: time="2024-11-12T17:40:25.795756264Z" level=info msg="skip loading plugin \"io.containerd.snapshotter.v1.btrfs\"..." error="path /var/lib/containerd/io.containerd.snapshotter.v1.btrfs (ext4) must be a btrfs filesystem to be used with the btrfs snapshotter: skip plugin" type=io.containerd.snapshotter.v1 Nov 12 17:40:25.800190 containerd[1940]: time="2024-11-12T17:40:25.798953760Z" level=info msg="loading plugin \"io.containerd.snapshotter.v1.devmapper\"..." type=io.containerd.snapshotter.v1 Nov 12 17:40:25.800190 containerd[1940]: time="2024-11-12T17:40:25.799041612Z" level=info msg="skip loading plugin \"io.containerd.snapshotter.v1.devmapper\"..." error="devmapper not configured: skip plugin" type=io.containerd.snapshotter.v1 Nov 12 17:40:25.800190 containerd[1940]: time="2024-11-12T17:40:25.799080684Z" level=info msg="loading plugin \"io.containerd.snapshotter.v1.native\"..." type=io.containerd.snapshotter.v1 Nov 12 17:40:25.800190 containerd[1940]: time="2024-11-12T17:40:25.799456548Z" level=info msg="loading plugin \"io.containerd.snapshotter.v1.overlayfs\"..." type=io.containerd.snapshotter.v1 Nov 12 17:40:25.802696 containerd[1940]: time="2024-11-12T17:40:25.802317372Z" level=info msg="loading plugin \"io.containerd.snapshotter.v1.zfs\"..." type=io.containerd.snapshotter.v1 Nov 12 17:40:25.803364 containerd[1940]: time="2024-11-12T17:40:25.803293164Z" level=info msg="skip loading plugin \"io.containerd.snapshotter.v1.zfs\"..." error="path /var/lib/containerd/io.containerd.snapshotter.v1.zfs must be a zfs filesystem to be used with the zfs snapshotter: skip plugin" type=io.containerd.snapshotter.v1 Nov 12 17:40:25.803595 containerd[1940]: time="2024-11-12T17:40:25.803547204Z" level=info msg="loading plugin \"io.containerd.content.v1.content\"..." type=io.containerd.content.v1 Nov 12 17:40:25.804130 containerd[1940]: time="2024-11-12T17:40:25.804064548Z" level=info msg="loading plugin \"io.containerd.metadata.v1.bolt\"..." type=io.containerd.metadata.v1 Nov 12 17:40:25.805935 containerd[1940]: time="2024-11-12T17:40:25.805870044Z" level=info msg="metadata content store policy set" policy=shared Nov 12 17:40:25.815478 containerd[1940]: time="2024-11-12T17:40:25.815376049Z" level=info msg="loading plugin \"io.containerd.gc.v1.scheduler\"..." type=io.containerd.gc.v1 Nov 12 17:40:25.818019 containerd[1940]: time="2024-11-12T17:40:25.815637025Z" level=info msg="loading plugin \"io.containerd.differ.v1.walking\"..." type=io.containerd.differ.v1 Nov 12 17:40:25.818019 containerd[1940]: time="2024-11-12T17:40:25.817366069Z" level=info msg="loading plugin \"io.containerd.lease.v1.manager\"..." type=io.containerd.lease.v1 Nov 12 17:40:25.818019 containerd[1940]: time="2024-11-12T17:40:25.817418941Z" level=info msg="loading plugin \"io.containerd.streaming.v1.manager\"..." type=io.containerd.streaming.v1 Nov 12 17:40:25.818019 containerd[1940]: time="2024-11-12T17:40:25.817471573Z" level=info msg="loading plugin \"io.containerd.runtime.v1.linux\"..." type=io.containerd.runtime.v1 Nov 12 17:40:25.818019 containerd[1940]: time="2024-11-12T17:40:25.817827637Z" level=info msg="loading plugin \"io.containerd.monitor.v1.cgroups\"..." type=io.containerd.monitor.v1 Nov 12 17:40:25.821173 containerd[1940]: time="2024-11-12T17:40:25.818903569Z" level=info msg="loading plugin \"io.containerd.runtime.v2.task\"..." type=io.containerd.runtime.v2 Nov 12 17:40:25.823187 containerd[1940]: time="2024-11-12T17:40:25.821714653Z" level=info msg="loading plugin \"io.containerd.runtime.v2.shim\"..." type=io.containerd.runtime.v2 Nov 12 17:40:25.823187 containerd[1940]: time="2024-11-12T17:40:25.821813425Z" level=info msg="loading plugin \"io.containerd.sandbox.store.v1.local\"..." type=io.containerd.sandbox.store.v1 Nov 12 17:40:25.823187 containerd[1940]: time="2024-11-12T17:40:25.821860009Z" level=info msg="loading plugin \"io.containerd.sandbox.controller.v1.local\"..." type=io.containerd.sandbox.controller.v1 Nov 12 17:40:25.823187 containerd[1940]: time="2024-11-12T17:40:25.821903233Z" level=info msg="loading plugin \"io.containerd.service.v1.containers-service\"..." type=io.containerd.service.v1 Nov 12 17:40:25.823187 containerd[1940]: time="2024-11-12T17:40:25.821940289Z" level=info msg="loading plugin \"io.containerd.service.v1.content-service\"..." type=io.containerd.service.v1 Nov 12 17:40:25.823187 containerd[1940]: time="2024-11-12T17:40:25.821975725Z" level=info msg="loading plugin \"io.containerd.service.v1.diff-service\"..." type=io.containerd.service.v1 Nov 12 17:40:25.823187 containerd[1940]: time="2024-11-12T17:40:25.822014377Z" level=info msg="loading plugin \"io.containerd.service.v1.images-service\"..." type=io.containerd.service.v1 Nov 12 17:40:25.823187 containerd[1940]: time="2024-11-12T17:40:25.822088489Z" level=info msg="loading plugin \"io.containerd.service.v1.introspection-service\"..." type=io.containerd.service.v1 Nov 12 17:40:25.823187 containerd[1940]: time="2024-11-12T17:40:25.822133165Z" level=info msg="loading plugin \"io.containerd.service.v1.namespaces-service\"..." type=io.containerd.service.v1 Nov 12 17:40:25.823187 containerd[1940]: time="2024-11-12T17:40:25.822234433Z" level=info msg="loading plugin \"io.containerd.service.v1.snapshots-service\"..." type=io.containerd.service.v1 Nov 12 17:40:25.823187 containerd[1940]: time="2024-11-12T17:40:25.822282397Z" level=info msg="loading plugin \"io.containerd.service.v1.tasks-service\"..." type=io.containerd.service.v1 Nov 12 17:40:25.823187 containerd[1940]: time="2024-11-12T17:40:25.822343525Z" level=info msg="loading plugin \"io.containerd.grpc.v1.containers\"..." type=io.containerd.grpc.v1 Nov 12 17:40:25.823187 containerd[1940]: time="2024-11-12T17:40:25.822389989Z" level=info msg="loading plugin \"io.containerd.grpc.v1.content\"..." type=io.containerd.grpc.v1 Nov 12 17:40:25.823187 containerd[1940]: time="2024-11-12T17:40:25.822424933Z" level=info msg="loading plugin \"io.containerd.grpc.v1.diff\"..." type=io.containerd.grpc.v1 Nov 12 17:40:25.823926 containerd[1940]: time="2024-11-12T17:40:25.822481837Z" level=info msg="loading plugin \"io.containerd.grpc.v1.events\"..." type=io.containerd.grpc.v1 Nov 12 17:40:25.823926 containerd[1940]: time="2024-11-12T17:40:25.822522097Z" level=info msg="loading plugin \"io.containerd.grpc.v1.images\"..." type=io.containerd.grpc.v1 Nov 12 17:40:25.823926 containerd[1940]: time="2024-11-12T17:40:25.822574357Z" level=info msg="loading plugin \"io.containerd.grpc.v1.introspection\"..." type=io.containerd.grpc.v1 Nov 12 17:40:25.823926 containerd[1940]: time="2024-11-12T17:40:25.822607585Z" level=info msg="loading plugin \"io.containerd.grpc.v1.leases\"..." type=io.containerd.grpc.v1 Nov 12 17:40:25.823926 containerd[1940]: time="2024-11-12T17:40:25.822641749Z" level=info msg="loading plugin \"io.containerd.grpc.v1.namespaces\"..." type=io.containerd.grpc.v1 Nov 12 17:40:25.823926 containerd[1940]: time="2024-11-12T17:40:25.822679549Z" level=info msg="loading plugin \"io.containerd.grpc.v1.sandbox-controllers\"..." type=io.containerd.grpc.v1 Nov 12 17:40:25.823926 containerd[1940]: time="2024-11-12T17:40:25.822740029Z" level=info msg="loading plugin \"io.containerd.grpc.v1.sandboxes\"..." type=io.containerd.grpc.v1 Nov 12 17:40:25.823926 containerd[1940]: time="2024-11-12T17:40:25.822792037Z" level=info msg="loading plugin \"io.containerd.grpc.v1.snapshots\"..." type=io.containerd.grpc.v1 Nov 12 17:40:25.823926 containerd[1940]: time="2024-11-12T17:40:25.822841597Z" level=info msg="loading plugin \"io.containerd.grpc.v1.streaming\"..." type=io.containerd.grpc.v1 Nov 12 17:40:25.823926 containerd[1940]: time="2024-11-12T17:40:25.822883573Z" level=info msg="loading plugin \"io.containerd.grpc.v1.tasks\"..." type=io.containerd.grpc.v1 Nov 12 17:40:25.823926 containerd[1940]: time="2024-11-12T17:40:25.822943441Z" level=info msg="loading plugin \"io.containerd.transfer.v1.local\"..." type=io.containerd.transfer.v1 Nov 12 17:40:25.823926 containerd[1940]: time="2024-11-12T17:40:25.822997597Z" level=info msg="loading plugin \"io.containerd.grpc.v1.transfer\"..." type=io.containerd.grpc.v1 Nov 12 17:40:25.823926 containerd[1940]: time="2024-11-12T17:40:25.823026997Z" level=info msg="loading plugin \"io.containerd.grpc.v1.version\"..." type=io.containerd.grpc.v1 Nov 12 17:40:25.823926 containerd[1940]: time="2024-11-12T17:40:25.823055077Z" level=info msg="loading plugin \"io.containerd.internal.v1.restart\"..." type=io.containerd.internal.v1 Nov 12 17:40:25.824745 amazon-ssm-agent[2061]: 2024-11-12 17:40:25 INFO http_proxy: Nov 12 17:40:25.829228 containerd[1940]: time="2024-11-12T17:40:25.827325673Z" level=info msg="loading plugin \"io.containerd.tracing.processor.v1.otlp\"..." type=io.containerd.tracing.processor.v1 Nov 12 17:40:25.829228 containerd[1940]: time="2024-11-12T17:40:25.827404837Z" level=info msg="skip loading plugin \"io.containerd.tracing.processor.v1.otlp\"..." error="skip plugin: tracing endpoint not configured" type=io.containerd.tracing.processor.v1 Nov 12 17:40:25.829228 containerd[1940]: time="2024-11-12T17:40:25.827433697Z" level=info msg="loading plugin \"io.containerd.internal.v1.tracing\"..." type=io.containerd.internal.v1 Nov 12 17:40:25.829228 containerd[1940]: time="2024-11-12T17:40:25.827462305Z" level=info msg="skip loading plugin \"io.containerd.internal.v1.tracing\"..." error="skip plugin: tracing endpoint not configured" type=io.containerd.internal.v1 Nov 12 17:40:25.829228 containerd[1940]: time="2024-11-12T17:40:25.827487205Z" level=info msg="loading plugin \"io.containerd.grpc.v1.healthcheck\"..." type=io.containerd.grpc.v1 Nov 12 17:40:25.829228 containerd[1940]: time="2024-11-12T17:40:25.827519065Z" level=info msg="loading plugin \"io.containerd.nri.v1.nri\"..." type=io.containerd.nri.v1 Nov 12 17:40:25.829228 containerd[1940]: time="2024-11-12T17:40:25.827545789Z" level=info msg="NRI interface is disabled by configuration." Nov 12 17:40:25.829228 containerd[1940]: time="2024-11-12T17:40:25.827572969Z" level=info msg="loading plugin \"io.containerd.grpc.v1.cri\"..." type=io.containerd.grpc.v1 Nov 12 17:40:25.829809 containerd[1940]: time="2024-11-12T17:40:25.828186901Z" level=info msg="Start cri plugin with config {PluginConfig:{ContainerdConfig:{Snapshotter:overlayfs DefaultRuntimeName:runc DefaultRuntime:{Type: Path: Engine: PodAnnotations:[] ContainerAnnotations:[] Root: Options:map[] PrivilegedWithoutHostDevices:false PrivilegedWithoutHostDevicesAllDevicesAllowed:false BaseRuntimeSpec: NetworkPluginConfDir: NetworkPluginMaxConfNum:0 Snapshotter: SandboxMode:} UntrustedWorkloadRuntime:{Type: Path: Engine: PodAnnotations:[] ContainerAnnotations:[] Root: Options:map[] PrivilegedWithoutHostDevices:false PrivilegedWithoutHostDevicesAllDevicesAllowed:false BaseRuntimeSpec: NetworkPluginConfDir: NetworkPluginMaxConfNum:0 Snapshotter: SandboxMode:} Runtimes:map[runc:{Type:io.containerd.runc.v2 Path: Engine: PodAnnotations:[] ContainerAnnotations:[] Root: Options:map[SystemdCgroup:true] PrivilegedWithoutHostDevices:false PrivilegedWithoutHostDevicesAllDevicesAllowed:false BaseRuntimeSpec: NetworkPluginConfDir: NetworkPluginMaxConfNum:0 Snapshotter: SandboxMode:podsandbox}] NoPivot:false DisableSnapshotAnnotations:true DiscardUnpackedLayers:false IgnoreBlockIONotEnabledErrors:false IgnoreRdtNotEnabledErrors:false} CniConfig:{NetworkPluginBinDir:/opt/cni/bin NetworkPluginConfDir:/etc/cni/net.d NetworkPluginMaxConfNum:1 NetworkPluginSetupSerially:false NetworkPluginConfTemplate: IPPreference:} Registry:{ConfigPath: Mirrors:map[] Configs:map[] Auths:map[] Headers:map[]} ImageDecryption:{KeyModel:node} DisableTCPService:true StreamServerAddress:127.0.0.1 StreamServerPort:0 StreamIdleTimeout:4h0m0s EnableSelinux:true SelinuxCategoryRange:1024 SandboxImage:registry.k8s.io/pause:3.8 StatsCollectPeriod:10 SystemdCgroup:false EnableTLSStreaming:false X509KeyPairStreaming:{TLSCertFile: TLSKeyFile:} MaxContainerLogLineSize:16384 DisableCgroup:false DisableApparmor:false RestrictOOMScoreAdj:false MaxConcurrentDownloads:3 DisableProcMount:false UnsetSeccompProfile: TolerateMissingHugetlbController:true DisableHugetlbController:true DeviceOwnershipFromSecurityContext:false IgnoreImageDefinedVolumes:false NetNSMountsUnderStateDir:false EnableUnprivilegedPorts:false EnableUnprivilegedICMP:false EnableCDI:false CDISpecDirs:[/etc/cdi /var/run/cdi] ImagePullProgressTimeout:5m0s DrainExecSyncIOTimeout:0s ImagePullWithSyncFs:false IgnoreDeprecationWarnings:[]} ContainerdRootDir:/var/lib/containerd ContainerdEndpoint:/run/containerd/containerd.sock RootDir:/var/lib/containerd/io.containerd.grpc.v1.cri StateDir:/run/containerd/io.containerd.grpc.v1.cri}" Nov 12 17:40:25.829809 containerd[1940]: time="2024-11-12T17:40:25.828328969Z" level=info msg="Connect containerd service" Nov 12 17:40:25.829809 containerd[1940]: time="2024-11-12T17:40:25.828417445Z" level=info msg="using legacy CRI server" Nov 12 17:40:25.829809 containerd[1940]: time="2024-11-12T17:40:25.828445285Z" level=info msg="using experimental NRI integration - disable nri plugin to prevent this" Nov 12 17:40:25.829809 containerd[1940]: time="2024-11-12T17:40:25.828652165Z" level=info msg="Get image filesystem path \"/var/lib/containerd/io.containerd.snapshotter.v1.overlayfs\"" Nov 12 17:40:25.837330 containerd[1940]: time="2024-11-12T17:40:25.835511173Z" level=error msg="failed to load cni during init, please check CRI plugin status before setting up network for pods" error="cni config load failed: no network config found in /etc/cni/net.d: cni plugin not initialized: failed to load cni config" Nov 12 17:40:25.837330 containerd[1940]: time="2024-11-12T17:40:25.835757833Z" level=info msg="Start subscribing containerd event" Nov 12 17:40:25.837330 containerd[1940]: time="2024-11-12T17:40:25.835858633Z" level=info msg="Start recovering state" Nov 12 17:40:25.837330 containerd[1940]: time="2024-11-12T17:40:25.836040025Z" level=info msg="Start event monitor" Nov 12 17:40:25.837330 containerd[1940]: time="2024-11-12T17:40:25.836082121Z" level=info msg="Start snapshots syncer" Nov 12 17:40:25.837330 containerd[1940]: time="2024-11-12T17:40:25.836109697Z" level=info msg="Start cni network conf syncer for default" Nov 12 17:40:25.837330 containerd[1940]: time="2024-11-12T17:40:25.836134513Z" level=info msg="Start streaming server" Nov 12 17:40:25.838169 containerd[1940]: time="2024-11-12T17:40:25.838098277Z" level=info msg=serving... address=/run/containerd/containerd.sock.ttrpc Nov 12 17:40:25.841297 containerd[1940]: time="2024-11-12T17:40:25.839555965Z" level=info msg=serving... address=/run/containerd/containerd.sock Nov 12 17:40:25.841297 containerd[1940]: time="2024-11-12T17:40:25.839779213Z" level=info msg="containerd successfully booted in 0.168946s" Nov 12 17:40:25.839977 systemd[1]: Started containerd.service - containerd container runtime. Nov 12 17:40:25.852762 systemd[1]: Starting docker.service - Docker Application Container Engine... Nov 12 17:40:25.882078 (dockerd)[2132]: docker.service: Referenced but unset environment variable evaluates to an empty string: DOCKER_CGROUPS, DOCKER_OPTS, DOCKER_OPT_BIP, DOCKER_OPT_IPMASQ, DOCKER_OPT_MTU Nov 12 17:40:25.926411 amazon-ssm-agent[2061]: 2024-11-12 17:40:25 INFO no_proxy: Nov 12 17:40:26.024793 amazon-ssm-agent[2061]: 2024-11-12 17:40:25 INFO Checking if agent identity type OnPrem can be assumed Nov 12 17:40:26.123582 amazon-ssm-agent[2061]: 2024-11-12 17:40:25 INFO Checking if agent identity type EC2 can be assumed Nov 12 17:40:26.222801 amazon-ssm-agent[2061]: 2024-11-12 17:40:25 INFO Agent will take identity from EC2 Nov 12 17:40:26.232592 amazon-ssm-agent[2061]: 2024-11-12 17:40:25 INFO [amazon-ssm-agent] using named pipe channel for IPC Nov 12 17:40:26.232592 amazon-ssm-agent[2061]: 2024-11-12 17:40:25 INFO [amazon-ssm-agent] using named pipe channel for IPC Nov 12 17:40:26.232592 amazon-ssm-agent[2061]: 2024-11-12 17:40:25 INFO [amazon-ssm-agent] using named pipe channel for IPC Nov 12 17:40:26.232592 amazon-ssm-agent[2061]: 2024-11-12 17:40:25 INFO [amazon-ssm-agent] amazon-ssm-agent - v3.2.0.0 Nov 12 17:40:26.232592 amazon-ssm-agent[2061]: 2024-11-12 17:40:25 INFO [amazon-ssm-agent] OS: linux, Arch: arm64 Nov 12 17:40:26.232592 amazon-ssm-agent[2061]: 2024-11-12 17:40:25 INFO [amazon-ssm-agent] Starting Core Agent Nov 12 17:40:26.232592 amazon-ssm-agent[2061]: 2024-11-12 17:40:25 INFO [amazon-ssm-agent] registrar detected. Attempting registration Nov 12 17:40:26.232592 amazon-ssm-agent[2061]: 2024-11-12 17:40:25 INFO [Registrar] Starting registrar module Nov 12 17:40:26.232592 amazon-ssm-agent[2061]: 2024-11-12 17:40:25 INFO [EC2Identity] no registration info found for ec2 instance, attempting registration Nov 12 17:40:26.232592 amazon-ssm-agent[2061]: 2024-11-12 17:40:26 INFO [EC2Identity] EC2 registration was successful. Nov 12 17:40:26.232592 amazon-ssm-agent[2061]: 2024-11-12 17:40:26 INFO [CredentialRefresher] credentialRefresher has started Nov 12 17:40:26.232592 amazon-ssm-agent[2061]: 2024-11-12 17:40:26 INFO [CredentialRefresher] Starting credentials refresher loop Nov 12 17:40:26.232592 amazon-ssm-agent[2061]: 2024-11-12 17:40:26 INFO EC2RoleProvider Successfully connected with instance profile role credentials Nov 12 17:40:26.322976 amazon-ssm-agent[2061]: 2024-11-12 17:40:26 INFO [CredentialRefresher] Next credential rotation will be in 30.716655419066665 minutes Nov 12 17:40:26.466389 sshd_keygen[1936]: ssh-keygen: generating new host keys: RSA ECDSA ED25519 Nov 12 17:40:26.530025 systemd[1]: Finished sshd-keygen.service - Generate sshd host keys. Nov 12 17:40:26.543682 systemd[1]: Starting issuegen.service - Generate /run/issue... Nov 12 17:40:26.558970 systemd[1]: Started sshd@0-172.31.30.96:22-139.178.89.65:37540.service - OpenSSH per-connection server daemon (139.178.89.65:37540). Nov 12 17:40:26.592889 systemd[1]: issuegen.service: Deactivated successfully. Nov 12 17:40:26.595354 systemd[1]: Finished issuegen.service - Generate /run/issue. Nov 12 17:40:26.612057 systemd[1]: Starting systemd-user-sessions.service - Permit User Sessions... Nov 12 17:40:26.636333 dockerd[2132]: time="2024-11-12T17:40:26.636231229Z" level=info msg="Starting up" Nov 12 17:40:26.655218 systemd[1]: Finished systemd-user-sessions.service - Permit User Sessions. Nov 12 17:40:26.668857 systemd[1]: Started getty@tty1.service - Getty on tty1. Nov 12 17:40:26.680935 systemd[1]: Started serial-getty@ttyS0.service - Serial Getty on ttyS0. Nov 12 17:40:26.684356 systemd[1]: Reached target getty.target - Login Prompts. Nov 12 17:40:26.805442 sshd[2150]: Accepted publickey for core from 139.178.89.65 port 37540 ssh2: RSA SHA256:1a90X/uDC0ILhfMiA2YbbwEMVTxtJewsfiol0dYezPk Nov 12 17:40:26.809808 sshd[2150]: pam_unix(sshd:session): session opened for user core(uid=500) by core(uid=0) Nov 12 17:40:26.844929 systemd-logind[1916]: New session 1 of user core. Nov 12 17:40:26.846612 systemd[1]: Created slice user-500.slice - User Slice of UID 500. Nov 12 17:40:26.854735 systemd[1]: Starting user-runtime-dir@500.service - User Runtime Directory /run/user/500... Nov 12 17:40:26.904885 systemd[1]: Finished user-runtime-dir@500.service - User Runtime Directory /run/user/500. Nov 12 17:40:26.920902 systemd[1]: Starting user@500.service - User Manager for UID 500... Nov 12 17:40:26.946743 (systemd)[2174]: pam_unix(systemd-user:session): session opened for user core(uid=500) by (uid=0) Nov 12 17:40:26.972756 systemd[1]: var-lib-docker-metacopy\x2dcheck3968427921-merged.mount: Deactivated successfully. Nov 12 17:40:27.010627 dockerd[2132]: time="2024-11-12T17:40:27.010552882Z" level=info msg="Loading containers: start." Nov 12 17:40:27.225051 kernel: Initializing XFRM netlink socket Nov 12 17:40:27.224745 systemd[2174]: Queued start job for default target default.target. Nov 12 17:40:27.238179 systemd[2174]: Created slice app.slice - User Application Slice. Nov 12 17:40:27.238265 systemd[2174]: Reached target paths.target - Paths. Nov 12 17:40:27.238303 systemd[2174]: Reached target timers.target - Timers. Nov 12 17:40:27.242999 systemd[2174]: Starting dbus.socket - D-Bus User Message Bus Socket... Nov 12 17:40:27.287965 (udev-worker)[1783]: Network interface NamePolicy= disabled on kernel command line. Nov 12 17:40:27.293447 systemd[2174]: Listening on dbus.socket - D-Bus User Message Bus Socket. Nov 12 17:40:27.297706 systemd[2174]: Reached target sockets.target - Sockets. Nov 12 17:40:27.297792 systemd[2174]: Reached target basic.target - Basic System. Nov 12 17:40:27.297942 systemd[2174]: Reached target default.target - Main User Target. Nov 12 17:40:27.298063 systemd[2174]: Startup finished in 333ms. Nov 12 17:40:27.298111 systemd[1]: Started user@500.service - User Manager for UID 500. Nov 12 17:40:27.307610 amazon-ssm-agent[2061]: 2024-11-12 17:40:27 INFO [amazon-ssm-agent] [LongRunningWorkerContainer] [WorkerProvider] Worker ssm-agent-worker is not running, starting worker process Nov 12 17:40:27.315412 systemd[1]: Started session-1.scope - Session 1 of User core. Nov 12 17:40:27.406020 amazon-ssm-agent[2061]: 2024-11-12 17:40:27 INFO [amazon-ssm-agent] [LongRunningWorkerContainer] [WorkerProvider] Worker ssm-agent-worker (pid:2235) started Nov 12 17:40:27.478999 systemd-networkd[1772]: docker0: Link UP Nov 12 17:40:27.509959 amazon-ssm-agent[2061]: 2024-11-12 17:40:27 INFO [amazon-ssm-agent] [LongRunningWorkerContainer] Monitor long running worker health every 60 seconds Nov 12 17:40:27.507493 systemd[1]: Started sshd@1-172.31.30.96:22-139.178.89.65:37552.service - OpenSSH per-connection server daemon (139.178.89.65:37552). Nov 12 17:40:27.566062 dockerd[2132]: time="2024-11-12T17:40:27.565978165Z" level=info msg="Loading containers: done." Nov 12 17:40:27.670369 dockerd[2132]: time="2024-11-12T17:40:27.670282562Z" level=warning msg="Not using native diff for overlay2, this may cause degraded performance for building images: kernel has CONFIG_OVERLAY_FS_REDIRECT_DIR enabled" storage-driver=overlay2 Nov 12 17:40:27.671384 dockerd[2132]: time="2024-11-12T17:40:27.670469030Z" level=info msg="Docker daemon" commit=061aa95809be396a6b5542618d8a34b02a21ff77 containerd-snapshotter=false storage-driver=overlay2 version=26.1.0 Nov 12 17:40:27.671384 dockerd[2132]: time="2024-11-12T17:40:27.670802126Z" level=info msg="Daemon has completed initialization" Nov 12 17:40:27.738330 sshd[2271]: Accepted publickey for core from 139.178.89.65 port 37552 ssh2: RSA SHA256:1a90X/uDC0ILhfMiA2YbbwEMVTxtJewsfiol0dYezPk Nov 12 17:40:27.744035 sshd[2271]: pam_unix(sshd:session): session opened for user core(uid=500) by core(uid=0) Nov 12 17:40:27.766408 systemd-logind[1916]: New session 2 of user core. Nov 12 17:40:27.773464 systemd[1]: Started session-2.scope - Session 2 of User core. Nov 12 17:40:27.797806 dockerd[2132]: time="2024-11-12T17:40:27.795090374Z" level=info msg="API listen on /run/docker.sock" Nov 12 17:40:27.795400 systemd[1]: Started docker.service - Docker Application Container Engine. Nov 12 17:40:27.799585 etcd-wrapper[2077]: Error response from daemon: No such container: etcd-member Nov 12 17:40:27.824530 etcd-wrapper[2307]: Error response from daemon: No such container: etcd-member Nov 12 17:40:27.868598 etcd-wrapper[2323]: Unable to find image 'quay.io/coreos/etcd:v3.5.0-arm64' locally Nov 12 17:40:27.898332 systemd[1]: var-lib-docker-overlay2-opaque\x2dbug\x2dcheck3003634686-merged.mount: Deactivated successfully. Nov 12 17:40:27.910595 sshd[2271]: pam_unix(sshd:session): session closed for user core Nov 12 17:40:27.916308 systemd[1]: sshd@1-172.31.30.96:22-139.178.89.65:37552.service: Deactivated successfully. Nov 12 17:40:27.919484 systemd[1]: session-2.scope: Deactivated successfully. Nov 12 17:40:27.922012 systemd-logind[1916]: Session 2 logged out. Waiting for processes to exit. Nov 12 17:40:27.925554 systemd-logind[1916]: Removed session 2. Nov 12 17:40:27.954746 systemd[1]: Started sshd@2-172.31.30.96:22-139.178.89.65:55402.service - OpenSSH per-connection server daemon (139.178.89.65:55402). Nov 12 17:40:28.147684 sshd[2332]: Accepted publickey for core from 139.178.89.65 port 55402 ssh2: RSA SHA256:1a90X/uDC0ILhfMiA2YbbwEMVTxtJewsfiol0dYezPk Nov 12 17:40:28.152958 sshd[2332]: pam_unix(sshd:session): session opened for user core(uid=500) by core(uid=0) Nov 12 17:40:28.166901 systemd-logind[1916]: New session 3 of user core. Nov 12 17:40:28.174659 systemd[1]: Started session-3.scope - Session 3 of User core. Nov 12 17:40:28.310046 sshd[2332]: pam_unix(sshd:session): session closed for user core Nov 12 17:40:28.316994 systemd[1]: sshd@2-172.31.30.96:22-139.178.89.65:55402.service: Deactivated successfully. Nov 12 17:40:28.321095 systemd[1]: session-3.scope: Deactivated successfully. Nov 12 17:40:28.323332 systemd-logind[1916]: Session 3 logged out. Waiting for processes to exit. Nov 12 17:40:28.326410 systemd-logind[1916]: Removed session 3. Nov 12 17:40:29.028929 etcd-wrapper[2323]: v3.5.0-arm64: Pulling from coreos/etcd Nov 12 17:40:29.028929 etcd-wrapper[2323]: 6022c6b01d76: Pulling fs layer Nov 12 17:40:29.028929 etcd-wrapper[2323]: 1d97b1ec77fc: Pulling fs layer Nov 12 17:40:29.028929 etcd-wrapper[2323]: 99ef4b690837: Pulling fs layer Nov 12 17:40:29.028929 etcd-wrapper[2323]: 435b7bf0967c: Pulling fs layer Nov 12 17:40:29.028929 etcd-wrapper[2323]: 17e4a5f7c1b5: Pulling fs layer Nov 12 17:40:29.028929 etcd-wrapper[2323]: 5b0292999756: Pulling fs layer Nov 12 17:40:29.028929 etcd-wrapper[2323]: 435b7bf0967c: Waiting Nov 12 17:40:29.028929 etcd-wrapper[2323]: 17e4a5f7c1b5: Waiting Nov 12 17:40:29.028929 etcd-wrapper[2323]: 5b0292999756: Waiting Nov 12 17:40:29.436566 etcd-wrapper[2323]: 99ef4b690837: Verifying Checksum Nov 12 17:40:29.436566 etcd-wrapper[2323]: 99ef4b690837: Download complete Nov 12 17:40:29.468619 etcd-wrapper[2323]: 1d97b1ec77fc: Verifying Checksum Nov 12 17:40:29.469223 etcd-wrapper[2323]: 1d97b1ec77fc: Download complete Nov 12 17:40:29.647388 etcd-wrapper[2323]: 6022c6b01d76: Verifying Checksum Nov 12 17:40:29.649846 etcd-wrapper[2323]: 6022c6b01d76: Download complete Nov 12 17:40:29.915729 etcd-wrapper[2323]: 435b7bf0967c: Verifying Checksum Nov 12 17:40:29.917408 etcd-wrapper[2323]: 435b7bf0967c: Download complete Nov 12 17:40:30.085395 etcd-wrapper[2323]: 5b0292999756: Verifying Checksum Nov 12 17:40:30.085395 etcd-wrapper[2323]: 5b0292999756: Download complete Nov 12 17:40:30.234921 etcd-wrapper[2323]: 17e4a5f7c1b5: Verifying Checksum Nov 12 17:40:30.234921 etcd-wrapper[2323]: 17e4a5f7c1b5: Download complete Nov 12 17:40:30.305764 ntpd[1910]: Listen normally on 6 eth0 [fe80::44c:dbff:fe4d:ebf1%2]:123 Nov 12 17:40:30.306980 ntpd[1910]: 12 Nov 17:40:30 ntpd[1910]: Listen normally on 6 eth0 [fe80::44c:dbff:fe4d:ebf1%2]:123 Nov 12 17:40:30.829927 systemd-resolved[1728]: Clock change detected. Flushing caches. Nov 12 17:40:31.088181 etcd-wrapper[2323]: 6022c6b01d76: Pull complete Nov 12 17:40:31.430201 systemd[1]: var-lib-docker-overlay2-f22f51b03123a669b5f4c33ea5a3c5e1e3fb90719b3789a08f50d246f7422476-merged.mount: Deactivated successfully. Nov 12 17:40:31.485733 etcd-wrapper[2323]: 1d97b1ec77fc: Pull complete Nov 12 17:40:31.607380 kernel: overlayfs: lowerdir is in-use as upperdir/workdir of another mount, accessing files from both mounts will result in undefined behavior. Nov 12 17:40:31.844586 systemd[1]: var-lib-docker-overlay2-25e737def34b8bf6f90ec1e0789747bf0f49b3bf062985b76ecbd81f03917057-merged.mount: Deactivated successfully. Nov 12 17:40:32.501465 etcd-wrapper[2323]: 99ef4b690837: Pull complete Nov 12 17:40:32.736444 systemd[1]: var-lib-docker-overlay2-3d3d983b335f87721a89f4c5839cda832f4420d033706517336a8d79d5fb9b03-merged.mount: Deactivated successfully. Nov 12 17:40:32.891035 etcd-wrapper[2323]: 435b7bf0967c: Pull complete Nov 12 17:40:32.929009 systemd[1]: var-lib-docker-overlay2-094bb7b5c0b175c1e744d389d748476ad4b11b9fb46708174ca11f610e105c70-merged.mount: Deactivated successfully. Nov 12 17:40:32.940747 etcd-wrapper[2323]: 17e4a5f7c1b5: Pull complete Nov 12 17:40:32.998639 etcd-wrapper[2323]: 5b0292999756: Pull complete Nov 12 17:40:33.013409 etcd-wrapper[2323]: Digest: sha256:96255d1ad67e7afcea46b4dc1b7e74024b9f6971193cb7316b093b3b5671efb0 Nov 12 17:40:33.029772 etcd-wrapper[2323]: Status: Downloaded newer image for quay.io/coreos/etcd:v3.5.0-arm64 Nov 12 17:40:33.426315 containerd[1940]: time="2024-11-12T17:40:33.426120284Z" level=info msg="loading plugin \"io.containerd.event.v1.publisher\"..." runtime=io.containerd.runc.v2 type=io.containerd.event.v1 Nov 12 17:40:33.426315 containerd[1940]: time="2024-11-12T17:40:33.426239972Z" level=info msg="loading plugin \"io.containerd.internal.v1.shutdown\"..." runtime=io.containerd.runc.v2 type=io.containerd.internal.v1 Nov 12 17:40:33.426315 containerd[1940]: time="2024-11-12T17:40:33.426267644Z" level=info msg="loading plugin \"io.containerd.ttrpc.v1.task\"..." runtime=io.containerd.runc.v2 type=io.containerd.ttrpc.v1 Nov 12 17:40:33.427673 containerd[1940]: time="2024-11-12T17:40:33.426493040Z" level=info msg="loading plugin \"io.containerd.ttrpc.v1.pause\"..." runtime=io.containerd.runc.v2 type=io.containerd.ttrpc.v1 Nov 12 17:40:33.482837 systemd[1]: Started docker-37f77a3a90c3bc0edd9e2e0a8f7d9d506bad6fcdf62ffbcec25f7d83a93c1bef.scope - libcontainer container 37f77a3a90c3bc0edd9e2e0a8f7d9d506bad6fcdf62ffbcec25f7d83a93c1bef. Nov 12 17:40:33.526375 systemd[1]: var-lib-docker-overlay2-ac3451598bd7b2d21b0ad49524e3240695130b7673af373078d17615f6147e61-merged.mount: Deactivated successfully. Nov 12 17:40:33.616959 etcd-wrapper[2323]: {"level":"info","ts":1731433233.616305,"caller":"flags/flag.go:113","msg":"recognized and used environment variable","variable-name":"ETCD_DATA_DIR","variable-value":"/var/lib/etcd"} Nov 12 17:40:33.618814 etcd-wrapper[2323]: {"level":"info","ts":1731433233.6178932,"caller":"flags/flag.go:113","msg":"recognized and used environment variable","variable-name":"ETCD_NAME","variable-value":"ec22bb7fc9328957bc837c83e4fb4b62"} Nov 12 17:40:33.619550 etcd-wrapper[2323]: {"level":"warn","ts":1731433233.6181278,"caller":"flags/flag.go:93","msg":"unrecognized environment variable","environment-variable":"ETCD_IMAGE_URL=quay.io/coreos/etcd"} Nov 12 17:40:33.619550 etcd-wrapper[2323]: {"level":"warn","ts":1731433233.619142,"caller":"flags/flag.go:93","msg":"unrecognized environment variable","environment-variable":"ETCD_IMAGE_TAG=v3.5.0-arm64"} Nov 12 17:40:33.620277 etcd-wrapper[2323]: {"level":"warn","ts":1731433233.6191707,"caller":"flags/flag.go:93","msg":"unrecognized environment variable","environment-variable":"ETCD_USER=etcd"} Nov 12 17:40:33.621229 etcd-wrapper[2323]: {"level":"warn","ts":1731433233.619933,"caller":"flags/flag.go:93","msg":"unrecognized environment variable","environment-variable":"ETCD_SSL_DIR=/etc/ssl/certs"} Nov 12 17:40:33.622090 etcd-wrapper[2323]: {"level":"warn","ts":1731433233.6207178,"caller":"flags/flag.go:93","msg":"unrecognized environment variable","environment-variable":"ETCD_UNSUPPORTED_ARCH=arm64"} Nov 12 17:40:33.623183 etcd-wrapper[2323]: {"level":"info","ts":"2024-11-12T17:40:33.622Z","caller":"etcdmain/etcd.go:72","msg":"Running: ","args":["/usr/local/bin/etcd","--listen-peer-urls=http://172.31.30.96:2380","--listen-client-urls=http://0.0.0.0:2379","--initial-advertise-peer-urls=http://172.31.30.96:2380","--advertise-client-urls=http://172.31.30.96:2379","--discovery=https://discovery.etcd.io/6af4a8711fe99c955e042d2851e09205"]} Nov 12 17:40:33.624066 etcd-wrapper[2323]: {"level":"info","ts":"2024-11-12T17:40:33.623Z","caller":"embed/etcd.go:131","msg":"configuring peer listeners","listen-peer-urls":["http://172.31.30.96:2380"]} Nov 12 17:40:33.624980 etcd-wrapper[2323]: {"level":"info","ts":"2024-11-12T17:40:33.624Z","caller":"embed/etcd.go:139","msg":"configuring client listeners","listen-client-urls":["http://0.0.0.0:2379"]} Nov 12 17:40:33.626989 etcd-wrapper[2323]: {"level":"info","ts":"2024-11-12T17:40:33.625Z","caller":"embed/etcd.go:307","msg":"starting an etcd server","etcd-version":"3.5.0","git-sha":"946a5a6f2","go-version":"go1.16.3","go-os":"linux","go-arch":"arm64","max-cpu-set":2,"max-cpu-available":2,"member-initialized":false,"name":"ec22bb7fc9328957bc837c83e4fb4b62","data-dir":"/var/lib/etcd","wal-dir":"","wal-dir-dedicated":"","member-dir":"/var/lib/etcd/member","force-new-cluster":false,"heartbeat-interval":"100ms","election-timeout":"1s","initial-election-tick-advance":true,"snapshot-count":100000,"snapshot-catchup-entries":5000,"initial-advertise-peer-urls":["http://172.31.30.96:2380"],"listen-peer-urls":["http://172.31.30.96:2380"],"advertise-client-urls":["http://172.31.30.96:2379"],"listen-client-urls":["http://0.0.0.0:2379"],"listen-metrics-urls":[],"cors":["*"],"host-whitelist":["*"],"initial-cluster":"ec22bb7fc9328957bc837c83e4fb4b62=http://172.31.30.96:2380","initial-cluster-state":"new","initial-cluster-token":"https://discovery.etcd.io/6af4a8711fe99c955e042d2851e09205","quota-size-bytes":2147483648,"pre-vote":true,"initial-corrupt-check":false,"corrupt-check-time-interval":"0s","auto-compaction-mode":"periodic","auto-compaction-retention":"0s","auto-compaction-interval":"0s","discovery-url":"https://discovery.etcd.io/6af4a8711fe99c955e042d2851e09205","discovery-proxy":"","downgrade-check-interval":"5s"} Nov 12 17:40:33.632024 etcd-wrapper[2323]: {"level":"info","ts":"2024-11-12T17:40:33.631Z","caller":"etcdserver/backend.go:81","msg":"opened backend db","path":"/var/lib/etcd/member/snap/db","took":"4.740312ms"} Nov 12 17:40:34.259897 etcd-wrapper[2323]: {"level":"info","ts":"2024-11-12T17:40:34.259Z","caller":"v2discovery/discovery.go:342","msg":"found peer from discovery server","discovery-url":"https://discovery.etcd.io","peer":"81462ec3d290699"} Nov 12 17:40:34.259897 etcd-wrapper[2323]: {"level":"info","ts":"2024-11-12T17:40:34.259Z","caller":"v2discovery/discovery.go:336","msg":"found self from discovery server","discovery-url":"https://discovery.etcd.io","self":"52922dd526de795c"} Nov 12 17:40:34.260582 etcd-wrapper[2323]: {"level":"info","ts":"2024-11-12T17:40:34.260Z","caller":"v2discovery/discovery.go:352","msg":"found peers from discovery server; waiting for more","discovery-url":"https://discovery.etcd.io","found-peers":2,"needed-peers":1} Nov 12 17:40:35.340793 etcd-wrapper[2323]: {"level":"info","ts":"2024-11-12T17:40:35.340Z","caller":"v2discovery/discovery.go:371","msg":"found peer from discovery server","discovery-url":"https://discovery.etcd.io","peer":"92175ab6d03730c7"} Nov 12 17:40:35.340793 etcd-wrapper[2323]: {"level":"info","ts":"2024-11-12T17:40:35.340Z","caller":"v2discovery/discovery.go:378","msg":"found all needed peers from discovery server","discovery-url":"https://discovery.etcd.io","found-peers":3} Nov 12 17:40:35.348046 etcd-wrapper[2323]: {"level":"info","ts":"2024-11-12T17:40:35.347Z","caller":"etcdserver/raft.go:448","msg":"starting local member","local-member-id":"52922dd526de795c","cluster-id":"145d1abd9f8805"} Nov 12 17:40:35.348969 etcd-wrapper[2323]: {"level":"info","ts":"2024-11-12T17:40:35.347Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"52922dd526de795c switched to configuration voters=()"} Nov 12 17:40:35.348969 etcd-wrapper[2323]: {"level":"info","ts":"2024-11-12T17:40:35.348Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"52922dd526de795c became follower at term 0"} Nov 12 17:40:35.348969 etcd-wrapper[2323]: {"level":"info","ts":"2024-11-12T17:40:35.348Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"newRaft 52922dd526de795c [peers: [], term: 0, commit: 0, applied: 0, lastindex: 0, lastterm: 0]"} Nov 12 17:40:35.348969 etcd-wrapper[2323]: {"level":"info","ts":"2024-11-12T17:40:35.348Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"52922dd526de795c became follower at term 1"} Nov 12 17:40:35.348969 etcd-wrapper[2323]: {"level":"info","ts":"2024-11-12T17:40:35.348Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"52922dd526de795c switched to configuration voters=(582199018615539353)"} Nov 12 17:40:35.350402 etcd-wrapper[2323]: {"level":"info","ts":"2024-11-12T17:40:35.348Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"52922dd526de795c switched to configuration voters=(582199018615539353 5949868451213244764)"} Nov 12 17:40:35.350402 etcd-wrapper[2323]: {"level":"info","ts":"2024-11-12T17:40:35.348Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"52922dd526de795c switched to configuration voters=(582199018615539353 5949868451213244764 10526982395225649351)"} Nov 12 17:40:35.351034 etcd-wrapper[2323]: {"level":"warn","ts":"2024-11-12T17:40:35.350Z","caller":"auth/store.go:1220","msg":"simple token is not cryptographically signed"} Nov 12 17:40:35.354159 etcd-wrapper[2323]: {"level":"info","ts":"2024-11-12T17:40:35.353Z","caller":"mvcc/kvstore.go:415","msg":"kvstore restored","current-rev":1} Nov 12 17:40:35.356522 etcd-wrapper[2323]: {"level":"info","ts":"2024-11-12T17:40:35.355Z","caller":"etcdserver/quota.go:94","msg":"enabled backend quota with default value","quota-name":"v3-applier","quota-size-bytes":2147483648,"quota-size":"2.1 GB"} Nov 12 17:40:35.358701 etcd-wrapper[2323]: {"level":"info","ts":"2024-11-12T17:40:35.357Z","caller":"rafthttp/peer.go:133","msg":"starting remote peer","remote-peer-id":"81462ec3d290699"} Nov 12 17:40:35.358701 etcd-wrapper[2323]: {"level":"info","ts":"2024-11-12T17:40:35.357Z","caller":"rafthttp/pipeline.go:72","msg":"started HTTP pipelining with remote peer","local-member-id":"52922dd526de795c","remote-peer-id":"81462ec3d290699"} Nov 12 17:40:35.362057 etcd-wrapper[2323]: {"level":"info","ts":"2024-11-12T17:40:35.358Z","caller":"rafthttp/stream.go:169","msg":"started stream writer with remote peer","local-member-id":"52922dd526de795c","remote-peer-id":"81462ec3d290699"} Nov 12 17:40:35.362057 etcd-wrapper[2323]: {"level":"info","ts":"2024-11-12T17:40:35.358Z","caller":"rafthttp/peer.go:137","msg":"started remote peer","remote-peer-id":"81462ec3d290699"} Nov 12 17:40:35.362057 etcd-wrapper[2323]: {"level":"info","ts":"2024-11-12T17:40:35.358Z","caller":"rafthttp/transport.go:317","msg":"added remote peer","local-member-id":"52922dd526de795c","remote-peer-id":"81462ec3d290699","remote-peer-urls":["http://172.31.17.51:2380"]} Nov 12 17:40:35.362057 etcd-wrapper[2323]: {"level":"info","ts":"2024-11-12T17:40:35.358Z","caller":"rafthttp/peer.go:133","msg":"starting remote peer","remote-peer-id":"92175ab6d03730c7"} Nov 12 17:40:35.362057 etcd-wrapper[2323]: {"level":"info","ts":"2024-11-12T17:40:35.358Z","caller":"rafthttp/pipeline.go:72","msg":"started HTTP pipelining with remote peer","local-member-id":"52922dd526de795c","remote-peer-id":"92175ab6d03730c7"} Nov 12 17:40:35.362057 etcd-wrapper[2323]: {"level":"info","ts":"2024-11-12T17:40:35.359Z","caller":"rafthttp/stream.go:169","msg":"started stream writer with remote peer","local-member-id":"52922dd526de795c","remote-peer-id":"81462ec3d290699"} Nov 12 17:40:35.362057 etcd-wrapper[2323]: {"level":"info","ts":"2024-11-12T17:40:35.360Z","caller":"rafthttp/stream.go:395","msg":"started stream reader with remote peer","stream-reader-type":"stream MsgApp v2","local-member-id":"52922dd526de795c","remote-peer-id":"81462ec3d290699"} Nov 12 17:40:35.362057 etcd-wrapper[2323]: {"level":"info","ts":"2024-11-12T17:40:35.361Z","caller":"rafthttp/stream.go:395","msg":"started stream reader with remote peer","stream-reader-type":"stream Message","local-member-id":"52922dd526de795c","remote-peer-id":"81462ec3d290699"} Nov 12 17:40:35.365359 etcd-wrapper[2323]: {"level":"info","ts":"2024-11-12T17:40:35.364Z","caller":"rafthttp/stream.go:169","msg":"started stream writer with remote peer","local-member-id":"52922dd526de795c","remote-peer-id":"92175ab6d03730c7"} Nov 12 17:40:35.366426 etcd-wrapper[2323]: {"level":"info","ts":"2024-11-12T17:40:35.365Z","caller":"rafthttp/stream.go:169","msg":"started stream writer with remote peer","local-member-id":"52922dd526de795c","remote-peer-id":"92175ab6d03730c7"} Nov 12 17:40:35.367788 etcd-wrapper[2323]: {"level":"info","ts":"2024-11-12T17:40:35.366Z","caller":"rafthttp/peer.go:137","msg":"started remote peer","remote-peer-id":"92175ab6d03730c7"} Nov 12 17:40:35.367788 etcd-wrapper[2323]: {"level":"info","ts":"2024-11-12T17:40:35.366Z","caller":"rafthttp/transport.go:317","msg":"added remote peer","local-member-id":"52922dd526de795c","remote-peer-id":"92175ab6d03730c7","remote-peer-urls":["http://172.31.20.146:2380"]} Nov 12 17:40:35.367788 etcd-wrapper[2323]: {"level":"info","ts":"2024-11-12T17:40:35.366Z","caller":"etcdserver/server.go:843","msg":"starting etcd server","local-member-id":"52922dd526de795c","local-server-version":"3.5.0","cluster-version":"to_be_decided"} Nov 12 17:40:35.368830 etcd-wrapper[2323]: {"level":"info","ts":"2024-11-12T17:40:35.368Z","caller":"rafthttp/stream.go:395","msg":"started stream reader with remote peer","stream-reader-type":"stream MsgApp v2","local-member-id":"52922dd526de795c","remote-peer-id":"92175ab6d03730c7"} Nov 12 17:40:35.369787 etcd-wrapper[2323]: {"level":"info","ts":"2024-11-12T17:40:35.369Z","caller":"rafthttp/stream.go:395","msg":"started stream reader with remote peer","stream-reader-type":"stream Message","local-member-id":"52922dd526de795c","remote-peer-id":"92175ab6d03730c7"} Nov 12 17:40:35.373217 etcd-wrapper[2323]: {"level":"info","ts":"2024-11-12T17:40:35.370Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"52922dd526de795c switched to configuration voters=(582199018615539353 5949868451213244764 10526982395225649351)"} Nov 12 17:40:35.373217 etcd-wrapper[2323]: {"level":"info","ts":"2024-11-12T17:40:35.371Z","caller":"membership/cluster.go:393","msg":"added member","cluster-id":"145d1abd9f8805","local-member-id":"52922dd526de795c","added-peer-id":"81462ec3d290699","added-peer-peer-urls":["http://172.31.17.51:2380"]} Nov 12 17:40:35.373217 etcd-wrapper[2323]: {"level":"info","ts":"2024-11-12T17:40:35.371Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"52922dd526de795c switched to configuration voters=(582199018615539353 5949868451213244764 10526982395225649351)"} Nov 12 17:40:35.373217 etcd-wrapper[2323]: {"level":"info","ts":"2024-11-12T17:40:35.371Z","caller":"membership/cluster.go:393","msg":"added member","cluster-id":"145d1abd9f8805","local-member-id":"52922dd526de795c","added-peer-id":"52922dd526de795c","added-peer-peer-urls":["http://172.31.30.96:2380"]} Nov 12 17:40:35.373217 etcd-wrapper[2323]: {"level":"info","ts":"2024-11-12T17:40:35.371Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"52922dd526de795c switched to configuration voters=(582199018615539353 5949868451213244764 10526982395225649351)"} Nov 12 17:40:35.373217 etcd-wrapper[2323]: {"level":"info","ts":"2024-11-12T17:40:35.371Z","caller":"membership/cluster.go:393","msg":"added member","cluster-id":"145d1abd9f8805","local-member-id":"52922dd526de795c","added-peer-id":"92175ab6d03730c7","added-peer-peer-urls":["http://172.31.20.146:2380"]} Nov 12 17:40:35.373217 etcd-wrapper[2323]: {"level":"info","ts":"2024-11-12T17:40:35.372Z","caller":"etcdserver/server.go:744","msg":"starting initial election tick advance","election-ticks":10} Nov 12 17:40:35.373217 etcd-wrapper[2323]: {"level":"info","ts":"2024-11-12T17:40:35.372Z","caller":"embed/etcd.go:276","msg":"now serving peer/client/metrics","local-member-id":"52922dd526de795c","initial-advertise-peer-urls":["http://172.31.30.96:2380"],"listen-peer-urls":["http://172.31.30.96:2380"],"advertise-client-urls":["http://172.31.30.96:2379"],"listen-client-urls":["http://0.0.0.0:2379"],"listen-metrics-urls":[]} Nov 12 17:40:35.373955 etcd-wrapper[2323]: {"level":"info","ts":"2024-11-12T17:40:35.372Z","caller":"embed/etcd.go:580","msg":"serving peer traffic","address":"172.31.30.96:2380"} Nov 12 17:40:35.373955 etcd-wrapper[2323]: {"level":"info","ts":"2024-11-12T17:40:35.372Z","caller":"embed/etcd.go:552","msg":"cmux::serve","address":"172.31.30.96:2380"} Nov 12 17:40:35.374565 etcd-wrapper[2323]: {"level":"info","ts":"2024-11-12T17:40:35.373Z","caller":"rafthttp/stream.go:249","msg":"set message encoder","from":"52922dd526de795c","to":"81462ec3d290699","stream-type":"stream Message"} Nov 12 17:40:35.374565 etcd-wrapper[2323]: {"level":"info","ts":"2024-11-12T17:40:35.373Z","caller":"rafthttp/peer_status.go:53","msg":"peer became active","peer-id":"81462ec3d290699"} Nov 12 17:40:35.374565 etcd-wrapper[2323]: {"level":"info","ts":"2024-11-12T17:40:35.373Z","caller":"rafthttp/stream.go:274","msg":"established TCP streaming connection with remote peer","stream-writer-type":"stream Message","local-member-id":"52922dd526de795c","remote-peer-id":"81462ec3d290699"} Nov 12 17:40:35.374565 etcd-wrapper[2323]: {"level":"info","ts":"2024-11-12T17:40:35.373Z","caller":"rafthttp/stream.go:249","msg":"set message encoder","from":"52922dd526de795c","to":"81462ec3d290699","stream-type":"stream MsgApp v2"} Nov 12 17:40:35.374565 etcd-wrapper[2323]: {"level":"info","ts":"2024-11-12T17:40:35.373Z","caller":"rafthttp/stream.go:274","msg":"established TCP streaming connection with remote peer","stream-writer-type":"stream MsgApp v2","local-member-id":"52922dd526de795c","remote-peer-id":"81462ec3d290699"} Nov 12 17:40:35.379118 etcd-wrapper[2323]: {"level":"info","ts":"2024-11-12T17:40:35.378Z","caller":"rafthttp/stream.go:412","msg":"established TCP streaming connection with remote peer","stream-reader-type":"stream Message","local-member-id":"52922dd526de795c","remote-peer-id":"81462ec3d290699"} Nov 12 17:40:35.379586 etcd-wrapper[2323]: {"level":"info","ts":"2024-11-12T17:40:35.379Z","caller":"rafthttp/stream.go:412","msg":"established TCP streaming connection with remote peer","stream-reader-type":"stream MsgApp v2","local-member-id":"52922dd526de795c","remote-peer-id":"81462ec3d290699"} Nov 12 17:40:36.650405 etcd-wrapper[2323]: {"level":"info","ts":"2024-11-12T17:40:36.649Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"52922dd526de795c is starting a new election at term 1"} Nov 12 17:40:36.650405 etcd-wrapper[2323]: {"level":"info","ts":"2024-11-12T17:40:36.649Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"52922dd526de795c became pre-candidate at term 1"} Nov 12 17:40:36.651103 etcd-wrapper[2323]: {"level":"info","ts":"2024-11-12T17:40:36.649Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"52922dd526de795c received MsgPreVoteResp from 52922dd526de795c at term 1"} Nov 12 17:40:36.651103 etcd-wrapper[2323]: {"level":"info","ts":"2024-11-12T17:40:36.650Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"52922dd526de795c [logterm: 1, index: 3] sent MsgPreVote request to 81462ec3d290699 at term 1"} Nov 12 17:40:36.651103 etcd-wrapper[2323]: {"level":"info","ts":"2024-11-12T17:40:36.650Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"52922dd526de795c [logterm: 1, index: 3] sent MsgPreVote request to 92175ab6d03730c7 at term 1"} Nov 12 17:40:36.651859 etcd-wrapper[2323]: {"level":"info","ts":"2024-11-12T17:40:36.650Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"52922dd526de795c received MsgPreVoteResp from 81462ec3d290699 at term 1"} Nov 12 17:40:36.651859 etcd-wrapper[2323]: {"level":"info","ts":"2024-11-12T17:40:36.651Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"52922dd526de795c has received 2 MsgPreVoteResp votes and 0 vote rejections"} Nov 12 17:40:36.651859 etcd-wrapper[2323]: {"level":"info","ts":"2024-11-12T17:40:36.651Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"52922dd526de795c became candidate at term 2"} Nov 12 17:40:36.651859 etcd-wrapper[2323]: {"level":"info","ts":"2024-11-12T17:40:36.651Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"52922dd526de795c received MsgVoteResp from 52922dd526de795c at term 2"} Nov 12 17:40:36.651859 etcd-wrapper[2323]: {"level":"info","ts":"2024-11-12T17:40:36.651Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"52922dd526de795c [logterm: 1, index: 3] sent MsgVote request to 81462ec3d290699 at term 2"} Nov 12 17:40:36.651859 etcd-wrapper[2323]: {"level":"info","ts":"2024-11-12T17:40:36.651Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"52922dd526de795c [logterm: 1, index: 3] sent MsgVote request to 92175ab6d03730c7 at term 2"} Nov 12 17:40:36.653862 etcd-wrapper[2323]: {"level":"info","ts":"2024-11-12T17:40:36.653Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"52922dd526de795c received MsgVoteResp from 81462ec3d290699 at term 2"} Nov 12 17:40:36.653862 etcd-wrapper[2323]: {"level":"info","ts":"2024-11-12T17:40:36.653Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"52922dd526de795c has received 2 MsgVoteResp votes and 0 vote rejections"} Nov 12 17:40:36.653862 etcd-wrapper[2323]: {"level":"info","ts":"2024-11-12T17:40:36.653Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"52922dd526de795c became leader at term 2"} Nov 12 17:40:36.653862 etcd-wrapper[2323]: {"level":"info","ts":"2024-11-12T17:40:36.653Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"raft.node: 52922dd526de795c elected leader 52922dd526de795c at term 2"} Nov 12 17:40:36.657569 etcd-wrapper[2323]: {"level":"info","ts":"2024-11-12T17:40:36.657Z","caller":"etcdserver/server.go:2027","msg":"published local member to cluster through raft","local-member-id":"52922dd526de795c","local-member-attributes":"{Name:ec22bb7fc9328957bc837c83e4fb4b62 ClientURLs:[http://172.31.30.96:2379]}","request-path":"/0/members/52922dd526de795c/attributes","cluster-id":"145d1abd9f8805","publish-timeout":"7s"} Nov 12 17:40:36.657986 etcd-wrapper[2323]: {"level":"info","ts":"2024-11-12T17:40:36.657Z","caller":"embed/serve.go:98","msg":"ready to serve client requests"} Nov 12 17:40:36.659794 etcd-wrapper[2323]: {"level":"info","ts":"2024-11-12T17:40:36.658Z","caller":"embed/serve.go:140","msg":"serving client traffic insecurely; this is strongly discouraged!","address":"[::]:2379"} Nov 12 17:40:36.660513 systemd[1]: Started etcd-member.service - etcd (System Application Container). Nov 12 17:40:36.662411 etcd-wrapper[2323]: {"level":"info","ts":"2024-11-12T17:40:36.659Z","caller":"etcdmain/main.go:47","msg":"notifying init daemon"} Nov 12 17:40:36.661617 systemd[1]: Reached target multi-user.target - Multi-User System. Nov 12 17:40:36.662793 etcd-wrapper[2323]: {"level":"info","ts":"2024-11-12T17:40:36.660Z","caller":"etcdmain/main.go:53","msg":"successfully notified init daemon"} Nov 12 17:40:36.666538 systemd[1]: Startup finished in 1.450s (kernel) + 8.343s (initrd) + 19.028s (userspace) = 28.822s. Nov 12 17:40:37.299084 etcd-wrapper[2323]: {"level":"info","ts":"2024-11-12T17:40:37.298Z","caller":"rafthttp/stream.go:249","msg":"set message encoder","from":"52922dd526de795c","to":"92175ab6d03730c7","stream-type":"stream MsgApp v2"} Nov 12 17:40:37.299084 etcd-wrapper[2323]: {"level":"info","ts":"2024-11-12T17:40:37.298Z","caller":"rafthttp/peer_status.go:53","msg":"peer became active","peer-id":"92175ab6d03730c7"} Nov 12 17:40:37.299084 etcd-wrapper[2323]: {"level":"info","ts":"2024-11-12T17:40:37.298Z","caller":"rafthttp/stream.go:274","msg":"established TCP streaming connection with remote peer","stream-writer-type":"stream MsgApp v2","local-member-id":"52922dd526de795c","remote-peer-id":"92175ab6d03730c7"} Nov 12 17:40:37.303828 etcd-wrapper[2323]: {"level":"info","ts":"2024-11-12T17:40:37.303Z","caller":"rafthttp/stream.go:249","msg":"set message encoder","from":"52922dd526de795c","to":"92175ab6d03730c7","stream-type":"stream Message"} Nov 12 17:40:37.303828 etcd-wrapper[2323]: {"level":"info","ts":"2024-11-12T17:40:37.303Z","caller":"rafthttp/stream.go:274","msg":"established TCP streaming connection with remote peer","stream-writer-type":"stream Message","local-member-id":"52922dd526de795c","remote-peer-id":"92175ab6d03730c7"} Nov 12 17:40:37.307680 etcd-wrapper[2323]: {"level":"info","ts":"2024-11-12T17:40:37.307Z","caller":"rafthttp/stream.go:412","msg":"established TCP streaming connection with remote peer","stream-reader-type":"stream MsgApp v2","local-member-id":"52922dd526de795c","remote-peer-id":"92175ab6d03730c7"} Nov 12 17:40:37.308315 etcd-wrapper[2323]: {"level":"info","ts":"2024-11-12T17:40:37.308Z","caller":"etcdserver/server.go:2476","msg":"setting up initial cluster version using v2 API","cluster-version":"3.5"} Nov 12 17:40:37.314379 etcd-wrapper[2323]: {"level":"info","ts":"2024-11-12T17:40:37.311Z","caller":"rafthttp/stream.go:412","msg":"established TCP streaming connection with remote peer","stream-reader-type":"stream Message","local-member-id":"52922dd526de795c","remote-peer-id":"92175ab6d03730c7"} Nov 12 17:40:37.319670 etcd-wrapper[2323]: {"level":"info","ts":"2024-11-12T17:40:37.318Z","caller":"membership/cluster.go:531","msg":"set initial cluster version","cluster-id":"145d1abd9f8805","local-member-id":"52922dd526de795c","cluster-version":"3.5"} Nov 12 17:40:37.319670 etcd-wrapper[2323]: {"level":"info","ts":"2024-11-12T17:40:37.318Z","caller":"api/capability.go:75","msg":"enabled capabilities for version","cluster-version":"3.5"} Nov 12 17:40:37.319670 etcd-wrapper[2323]: {"level":"info","ts":"2024-11-12T17:40:37.319Z","caller":"etcdserver/server.go:2500","msg":"cluster version is updated","cluster-version":"3.5"} Nov 12 17:40:37.340757 etcd-wrapper[2323]: {"level":"info","ts":"2024-11-12T17:40:37.340Z","caller":"etcdserver/server.go:767","msg":"initialized peer connections; fast-forwarding election ticks","local-member-id":"52922dd526de795c","forward-ticks":8,"forward-duration":"800ms","election-ticks":10,"election-timeout":"1s","active-remote-members":2} Nov 12 17:40:37.874451 systemd[1]: Started sshd@3-172.31.30.96:22-139.178.89.65:35258.service - OpenSSH per-connection server daemon (139.178.89.65:35258). Nov 12 17:40:38.066251 sshd[2423]: Accepted publickey for core from 139.178.89.65 port 35258 ssh2: RSA SHA256:1a90X/uDC0ILhfMiA2YbbwEMVTxtJewsfiol0dYezPk Nov 12 17:40:38.068918 sshd[2423]: pam_unix(sshd:session): session opened for user core(uid=500) by core(uid=0) Nov 12 17:40:38.077275 systemd-logind[1916]: New session 4 of user core. Nov 12 17:40:38.087774 systemd[1]: Started session-4.scope - Session 4 of User core. Nov 12 17:40:38.219142 sshd[2423]: pam_unix(sshd:session): session closed for user core Nov 12 17:40:38.226903 systemd[1]: sshd@3-172.31.30.96:22-139.178.89.65:35258.service: Deactivated successfully. Nov 12 17:40:38.230818 systemd[1]: session-4.scope: Deactivated successfully. Nov 12 17:40:38.233799 systemd-logind[1916]: Session 4 logged out. Waiting for processes to exit. Nov 12 17:40:38.236679 systemd-logind[1916]: Removed session 4. Nov 12 17:40:38.262041 systemd[1]: Started sshd@4-172.31.30.96:22-139.178.89.65:35262.service - OpenSSH per-connection server daemon (139.178.89.65:35262). Nov 12 17:40:38.446064 sshd[2430]: Accepted publickey for core from 139.178.89.65 port 35262 ssh2: RSA SHA256:1a90X/uDC0ILhfMiA2YbbwEMVTxtJewsfiol0dYezPk Nov 12 17:40:38.449318 sshd[2430]: pam_unix(sshd:session): session opened for user core(uid=500) by core(uid=0) Nov 12 17:40:38.460839 systemd-logind[1916]: New session 5 of user core. Nov 12 17:40:38.467757 systemd[1]: Started session-5.scope - Session 5 of User core. Nov 12 17:40:38.589278 sshd[2430]: pam_unix(sshd:session): session closed for user core Nov 12 17:40:38.598190 systemd[1]: sshd@4-172.31.30.96:22-139.178.89.65:35262.service: Deactivated successfully. Nov 12 17:40:38.603727 systemd[1]: session-5.scope: Deactivated successfully. Nov 12 17:40:38.606125 systemd-logind[1916]: Session 5 logged out. Waiting for processes to exit. Nov 12 17:40:38.609473 systemd-logind[1916]: Removed session 5. Nov 12 17:40:38.633888 systemd[1]: Started sshd@5-172.31.30.96:22-139.178.89.65:35264.service - OpenSSH per-connection server daemon (139.178.89.65:35264). Nov 12 17:40:38.822950 sshd[2437]: Accepted publickey for core from 139.178.89.65 port 35264 ssh2: RSA SHA256:1a90X/uDC0ILhfMiA2YbbwEMVTxtJewsfiol0dYezPk Nov 12 17:40:38.826256 sshd[2437]: pam_unix(sshd:session): session opened for user core(uid=500) by core(uid=0) Nov 12 17:40:38.837519 systemd-logind[1916]: New session 6 of user core. Nov 12 17:40:38.848849 systemd[1]: Started session-6.scope - Session 6 of User core. Nov 12 17:40:38.989303 sshd[2437]: pam_unix(sshd:session): session closed for user core Nov 12 17:40:38.995592 systemd[1]: sshd@5-172.31.30.96:22-139.178.89.65:35264.service: Deactivated successfully. Nov 12 17:40:38.999538 systemd[1]: session-6.scope: Deactivated successfully. Nov 12 17:40:39.004003 systemd-logind[1916]: Session 6 logged out. Waiting for processes to exit. Nov 12 17:40:39.007063 systemd-logind[1916]: Removed session 6. Nov 12 17:40:39.030899 systemd[1]: Started sshd@6-172.31.30.96:22-139.178.89.65:35278.service - OpenSSH per-connection server daemon (139.178.89.65:35278). Nov 12 17:40:39.219805 sshd[2445]: Accepted publickey for core from 139.178.89.65 port 35278 ssh2: RSA SHA256:1a90X/uDC0ILhfMiA2YbbwEMVTxtJewsfiol0dYezPk Nov 12 17:40:39.222520 sshd[2445]: pam_unix(sshd:session): session opened for user core(uid=500) by core(uid=0) Nov 12 17:40:39.230883 systemd-logind[1916]: New session 7 of user core. Nov 12 17:40:39.244675 systemd[1]: Started session-7.scope - Session 7 of User core. Nov 12 17:40:39.368829 sudo[2448]: core : PWD=/home/core ; USER=root ; COMMAND=/usr/sbin/setenforce 1 Nov 12 17:40:39.369723 sudo[2448]: pam_unix(sudo:session): session opened for user root(uid=0) by core(uid=500) Nov 12 17:40:39.389246 sudo[2448]: pam_unix(sudo:session): session closed for user root Nov 12 17:40:39.414872 sshd[2445]: pam_unix(sshd:session): session closed for user core Nov 12 17:40:39.421726 systemd[1]: sshd@6-172.31.30.96:22-139.178.89.65:35278.service: Deactivated successfully. Nov 12 17:40:39.426928 systemd[1]: session-7.scope: Deactivated successfully. Nov 12 17:40:39.431619 systemd-logind[1916]: Session 7 logged out. Waiting for processes to exit. Nov 12 17:40:39.435498 systemd-logind[1916]: Removed session 7. Nov 12 17:40:39.458056 systemd[1]: Started sshd@7-172.31.30.96:22-139.178.89.65:35290.service - OpenSSH per-connection server daemon (139.178.89.65:35290). Nov 12 17:40:39.649316 sshd[2453]: Accepted publickey for core from 139.178.89.65 port 35290 ssh2: RSA SHA256:1a90X/uDC0ILhfMiA2YbbwEMVTxtJewsfiol0dYezPk Nov 12 17:40:39.654751 sshd[2453]: pam_unix(sshd:session): session opened for user core(uid=500) by core(uid=0) Nov 12 17:40:39.668481 systemd-logind[1916]: New session 8 of user core. Nov 12 17:40:39.679777 systemd[1]: Started session-8.scope - Session 8 of User core. Nov 12 17:40:39.796400 sudo[2457]: core : PWD=/home/core ; USER=root ; COMMAND=/usr/bin/rm -rf /etc/audit/rules.d/80-selinux.rules /etc/audit/rules.d/99-default.rules Nov 12 17:40:39.797462 sudo[2457]: pam_unix(sudo:session): session opened for user root(uid=0) by core(uid=500) Nov 12 17:40:39.807734 sudo[2457]: pam_unix(sudo:session): session closed for user root Nov 12 17:40:39.819246 sudo[2456]: core : PWD=/home/core ; USER=root ; COMMAND=/usr/bin/systemctl restart audit-rules Nov 12 17:40:39.820035 sudo[2456]: pam_unix(sudo:session): session opened for user root(uid=0) by core(uid=500) Nov 12 17:40:39.848997 systemd[1]: Stopping audit-rules.service - Load Security Auditing Rules... Nov 12 17:40:39.865510 auditctl[2460]: No rules Nov 12 17:40:39.866896 systemd[1]: audit-rules.service: Deactivated successfully. Nov 12 17:40:39.867692 systemd[1]: Stopped audit-rules.service - Load Security Auditing Rules. Nov 12 17:40:39.878747 systemd[1]: Starting audit-rules.service - Load Security Auditing Rules... Nov 12 17:40:39.951559 augenrules[2478]: No rules Nov 12 17:40:39.952865 systemd[1]: Finished audit-rules.service - Load Security Auditing Rules. Nov 12 17:40:39.955059 sudo[2456]: pam_unix(sudo:session): session closed for user root Nov 12 17:40:39.980866 sshd[2453]: pam_unix(sshd:session): session closed for user core Nov 12 17:40:39.989712 systemd[1]: sshd@7-172.31.30.96:22-139.178.89.65:35290.service: Deactivated successfully. Nov 12 17:40:39.994254 systemd[1]: session-8.scope: Deactivated successfully. Nov 12 17:40:39.996503 systemd-logind[1916]: Session 8 logged out. Waiting for processes to exit. Nov 12 17:40:39.999260 systemd-logind[1916]: Removed session 8. Nov 12 17:40:46.408894 systemd[1]: Started sshd@8-172.31.30.96:22-139.178.89.65:35292.service - OpenSSH per-connection server daemon (139.178.89.65:35292). Nov 12 17:40:46.585789 sshd[2486]: Accepted publickey for core from 139.178.89.65 port 35292 ssh2: RSA SHA256:1a90X/uDC0ILhfMiA2YbbwEMVTxtJewsfiol0dYezPk Nov 12 17:40:46.588940 sshd[2486]: pam_unix(sshd:session): session opened for user core(uid=500) by core(uid=0) Nov 12 17:40:46.599434 systemd-logind[1916]: New session 9 of user core. Nov 12 17:40:46.607821 systemd[1]: Started session-9.scope - Session 9 of User core. Nov 12 17:40:46.931552 sshd[2486]: pam_unix(sshd:session): session closed for user core Nov 12 17:40:46.940657 systemd[1]: sshd@8-172.31.30.96:22-139.178.89.65:35292.service: Deactivated successfully. Nov 12 17:40:46.946199 systemd[1]: session-9.scope: Deactivated successfully. Nov 12 17:40:46.950596 systemd-logind[1916]: Session 9 logged out. Waiting for processes to exit. Nov 12 17:40:46.954060 systemd-logind[1916]: Removed session 9.