May 27 17:00:21.109637 kernel: Booting Linux on physical CPU 0x0000000000 [0x410fd083] May 27 17:00:21.109683 kernel: Linux version 6.12.30-flatcar (build@pony-truck.infra.kinvolk.io) (aarch64-cros-linux-gnu-gcc (Gentoo Hardened 14.2.1_p20241221 p7) 14.2.1 20241221, GNU ld (Gentoo 2.44 p1) 2.44.0) #1 SMP PREEMPT Tue May 27 15:31:23 -00 2025 May 27 17:00:21.109709 kernel: KASLR disabled due to lack of seed May 27 17:00:21.109726 kernel: efi: EFI v2.7 by EDK II May 27 17:00:21.109742 kernel: efi: SMBIOS=0x7bed0000 SMBIOS 3.0=0x7beb0000 ACPI=0x786e0000 ACPI 2.0=0x786e0014 MEMATTR=0x7a733a98 MEMRESERVE=0x78551598 May 27 17:00:21.109757 kernel: secureboot: Secure boot disabled May 27 17:00:21.109775 kernel: ACPI: Early table checksum verification disabled May 27 17:00:21.109789 kernel: ACPI: RSDP 0x00000000786E0014 000024 (v02 AMAZON) May 27 17:00:21.109805 kernel: ACPI: XSDT 0x00000000786D00E8 000064 (v01 AMAZON AMZNFACP 00000001 01000013) May 27 17:00:21.109821 kernel: ACPI: FACP 0x00000000786B0000 000114 (v06 AMAZON AMZNFACP 00000001 AMZN 00000001) May 27 17:00:21.109842 kernel: ACPI: DSDT 0x0000000078640000 00159D (v02 AMAZON AMZNDSDT 00000001 INTL 20160527) May 27 17:00:21.109858 kernel: ACPI: FACS 0x0000000078630000 000040 May 27 17:00:21.109875 kernel: ACPI: APIC 0x00000000786C0000 000108 (v04 AMAZON AMZNAPIC 00000001 AMZN 00000001) May 27 17:00:21.109891 kernel: ACPI: SPCR 0x00000000786A0000 000050 (v02 AMAZON AMZNSPCR 00000001 AMZN 00000001) May 27 17:00:21.109909 kernel: ACPI: GTDT 0x0000000078690000 000060 (v02 AMAZON AMZNGTDT 00000001 AMZN 00000001) May 27 17:00:21.109926 kernel: ACPI: MCFG 0x0000000078680000 00003C (v02 AMAZON AMZNMCFG 00000001 AMZN 00000001) May 27 17:00:21.109984 kernel: ACPI: SLIT 0x0000000078670000 00002D (v01 AMAZON AMZNSLIT 00000001 AMZN 00000001) May 27 17:00:21.110004 kernel: ACPI: IORT 0x0000000078660000 000078 (v01 AMAZON AMZNIORT 00000001 AMZN 00000001) May 27 17:00:21.110022 kernel: ACPI: PPTT 0x0000000078650000 0000EC (v01 AMAZON AMZNPPTT 00000001 AMZN 00000001) May 27 17:00:21.110039 kernel: ACPI: SPCR: console: uart,mmio,0x90a0000,115200 May 27 17:00:21.110056 kernel: earlycon: uart0 at MMIO 0x00000000090a0000 (options '115200') May 27 17:00:21.110072 kernel: printk: legacy bootconsole [uart0] enabled May 27 17:00:21.110090 kernel: ACPI: Use ACPI SPCR as default console: Yes May 27 17:00:21.110107 kernel: NUMA: Faking a node at [mem 0x0000000040000000-0x00000004b5ffffff] May 27 17:00:21.110124 kernel: NODE_DATA(0) allocated [mem 0x4b584cdc0-0x4b5853fff] May 27 17:00:21.110141 kernel: Zone ranges: May 27 17:00:21.110165 kernel: DMA [mem 0x0000000040000000-0x00000000ffffffff] May 27 17:00:21.110182 kernel: DMA32 empty May 27 17:00:21.110200 kernel: Normal [mem 0x0000000100000000-0x00000004b5ffffff] May 27 17:00:21.110215 kernel: Device empty May 27 17:00:21.110231 kernel: Movable zone start for each node May 27 17:00:21.110247 kernel: Early memory node ranges May 27 17:00:21.110262 kernel: node 0: [mem 0x0000000040000000-0x000000007862ffff] May 27 17:00:21.110278 kernel: node 0: [mem 0x0000000078630000-0x000000007863ffff] May 27 17:00:21.110295 kernel: node 0: [mem 0x0000000078640000-0x00000000786effff] May 27 17:00:21.110311 kernel: node 0: [mem 0x00000000786f0000-0x000000007872ffff] May 27 17:00:21.110326 kernel: node 0: [mem 0x0000000078730000-0x000000007bbfffff] May 27 17:00:21.110342 kernel: node 0: [mem 0x000000007bc00000-0x000000007bfdffff] May 27 17:00:21.110363 kernel: node 0: [mem 0x000000007bfe0000-0x000000007fffffff] May 27 17:00:21.110380 kernel: node 0: [mem 0x0000000400000000-0x00000004b5ffffff] May 27 17:00:21.110406 kernel: Initmem setup node 0 [mem 0x0000000040000000-0x00000004b5ffffff] May 27 17:00:21.110423 kernel: On node 0, zone Normal: 8192 pages in unavailable ranges May 27 17:00:21.110464 kernel: psci: probing for conduit method from ACPI. May 27 17:00:21.110488 kernel: psci: PSCIv1.0 detected in firmware. May 27 17:00:21.110506 kernel: psci: Using standard PSCI v0.2 function IDs May 27 17:00:21.110522 kernel: psci: Trusted OS migration not required May 27 17:00:21.110539 kernel: psci: SMC Calling Convention v1.1 May 27 17:00:21.110556 kernel: percpu: Embedded 33 pages/cpu s98136 r8192 d28840 u135168 May 27 17:00:21.110573 kernel: pcpu-alloc: s98136 r8192 d28840 u135168 alloc=33*4096 May 27 17:00:21.110591 kernel: pcpu-alloc: [0] 0 [0] 1 May 27 17:00:21.110608 kernel: Detected PIPT I-cache on CPU0 May 27 17:00:21.110626 kernel: CPU features: detected: GIC system register CPU interface May 27 17:00:21.110643 kernel: CPU features: detected: Spectre-v2 May 27 17:00:21.110661 kernel: CPU features: detected: Spectre-v3a May 27 17:00:21.110679 kernel: CPU features: detected: Spectre-BHB May 27 17:00:21.110703 kernel: CPU features: detected: ARM erratum 1742098 May 27 17:00:21.110721 kernel: CPU features: detected: ARM errata 1165522, 1319367, or 1530923 May 27 17:00:21.110738 kernel: alternatives: applying boot alternatives May 27 17:00:21.110758 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=4e706b869299e1c88703222069cdfa08c45ebce568f762053eea5b3f5f0939c3 May 27 17:00:21.110776 kernel: Unknown kernel command line parameters "BOOT_IMAGE=/flatcar/vmlinuz-a", will be passed to user space. May 27 17:00:21.110794 kernel: Dentry cache hash table entries: 524288 (order: 10, 4194304 bytes, linear) May 27 17:00:21.110811 kernel: Inode-cache hash table entries: 262144 (order: 9, 2097152 bytes, linear) May 27 17:00:21.110829 kernel: Fallback order for Node 0: 0 May 27 17:00:21.110846 kernel: Built 1 zonelists, mobility grouping on. Total pages: 1007616 May 27 17:00:21.110863 kernel: Policy zone: Normal May 27 17:00:21.110886 kernel: mem auto-init: stack:off, heap alloc:off, heap free:off May 27 17:00:21.110903 kernel: software IO TLB: area num 2. May 27 17:00:21.110921 kernel: software IO TLB: mapped [mem 0x000000007c000000-0x0000000080000000] (64MB) May 27 17:00:21.112009 kernel: SLUB: HWalign=64, Order=0-3, MinObjects=0, CPUs=2, Nodes=1 May 27 17:00:21.112059 kernel: rcu: Preemptible hierarchical RCU implementation. May 27 17:00:21.112079 kernel: rcu: RCU event tracing is enabled. May 27 17:00:21.112097 kernel: rcu: RCU restricting CPUs from NR_CPUS=512 to nr_cpu_ids=2. May 27 17:00:21.112116 kernel: Trampoline variant of Tasks RCU enabled. May 27 17:00:21.112133 kernel: Tracing variant of Tasks RCU enabled. May 27 17:00:21.112151 kernel: rcu: RCU calculated value of scheduler-enlistment delay is 100 jiffies. May 27 17:00:21.112168 kernel: rcu: Adjusting geometry for rcu_fanout_leaf=16, nr_cpu_ids=2 May 27 17:00:21.112186 kernel: RCU Tasks: Setting shift to 1 and lim to 1 rcu_task_cb_adjust=1 rcu_task_cpu_ids=2. May 27 17:00:21.112215 kernel: RCU Tasks Trace: Setting shift to 1 and lim to 1 rcu_task_cb_adjust=1 rcu_task_cpu_ids=2. May 27 17:00:21.112232 kernel: NR_IRQS: 64, nr_irqs: 64, preallocated irqs: 0 May 27 17:00:21.112249 kernel: GICv3: 96 SPIs implemented May 27 17:00:21.112265 kernel: GICv3: 0 Extended SPIs implemented May 27 17:00:21.112282 kernel: Root IRQ handler: gic_handle_irq May 27 17:00:21.112299 kernel: GICv3: GICv3 features: 16 PPIs May 27 17:00:21.112315 kernel: GICv3: GICD_CTRL.DS=1, SCR_EL3.FIQ=0 May 27 17:00:21.112332 kernel: GICv3: CPU0: found redistributor 0 region 0:0x0000000010200000 May 27 17:00:21.112349 kernel: ITS [mem 0x10080000-0x1009ffff] May 27 17:00:21.112365 kernel: ITS@0x0000000010080000: allocated 8192 Devices @4000c0000 (indirect, esz 8, psz 64K, shr 1) May 27 17:00:21.112382 kernel: ITS@0x0000000010080000: allocated 8192 Interrupt Collections @4000d0000 (flat, esz 8, psz 64K, shr 1) May 27 17:00:21.112404 kernel: GICv3: using LPI property table @0x00000004000e0000 May 27 17:00:21.112422 kernel: ITS: Using hypervisor restricted LPI range [128] May 27 17:00:21.112438 kernel: GICv3: CPU0: using allocated LPI pending table @0x00000004000f0000 May 27 17:00:21.112455 kernel: rcu: srcu_init: Setting srcu_struct sizes based on contention. May 27 17:00:21.112472 kernel: arch_timer: cp15 timer(s) running at 83.33MHz (virt). May 27 17:00:21.112489 kernel: clocksource: arch_sys_counter: mask: 0x1ffffffffffffff max_cycles: 0x13381ebeec, max_idle_ns: 440795203145 ns May 27 17:00:21.112505 kernel: sched_clock: 57 bits at 83MHz, resolution 12ns, wraps every 4398046511100ns May 27 17:00:21.112522 kernel: Console: colour dummy device 80x25 May 27 17:00:21.112540 kernel: printk: legacy console [tty1] enabled May 27 17:00:21.112558 kernel: ACPI: Core revision 20240827 May 27 17:00:21.112576 kernel: Calibrating delay loop (skipped), value calculated using timer frequency.. 166.66 BogoMIPS (lpj=83333) May 27 17:00:21.112598 kernel: pid_max: default: 32768 minimum: 301 May 27 17:00:21.112615 kernel: LSM: initializing lsm=lockdown,capability,landlock,selinux,ima May 27 17:00:21.112632 kernel: landlock: Up and running. May 27 17:00:21.112649 kernel: SELinux: Initializing. May 27 17:00:21.112666 kernel: Mount-cache hash table entries: 8192 (order: 4, 65536 bytes, linear) May 27 17:00:21.112683 kernel: Mountpoint-cache hash table entries: 8192 (order: 4, 65536 bytes, linear) May 27 17:00:21.112700 kernel: rcu: Hierarchical SRCU implementation. May 27 17:00:21.112718 kernel: rcu: Max phase no-delay instances is 400. May 27 17:00:21.112735 kernel: Timer migration: 1 hierarchy levels; 8 children per group; 1 crossnode level May 27 17:00:21.112756 kernel: Remapping and enabling EFI services. May 27 17:00:21.112773 kernel: smp: Bringing up secondary CPUs ... May 27 17:00:21.112790 kernel: Detected PIPT I-cache on CPU1 May 27 17:00:21.112807 kernel: GICv3: CPU1: found redistributor 1 region 0:0x0000000010220000 May 27 17:00:21.112825 kernel: GICv3: CPU1: using allocated LPI pending table @0x0000000400100000 May 27 17:00:21.112842 kernel: CPU1: Booted secondary processor 0x0000000001 [0x410fd083] May 27 17:00:21.112859 kernel: smp: Brought up 1 node, 2 CPUs May 27 17:00:21.112876 kernel: SMP: Total of 2 processors activated. May 27 17:00:21.112893 kernel: CPU: All CPU(s) started at EL1 May 27 17:00:21.112915 kernel: CPU features: detected: 32-bit EL0 Support May 27 17:00:21.112980 kernel: CPU features: detected: 32-bit EL1 Support May 27 17:00:21.113004 kernel: CPU features: detected: CRC32 instructions May 27 17:00:21.113032 kernel: alternatives: applying system-wide alternatives May 27 17:00:21.113052 kernel: Memory: 3813536K/4030464K available (11072K kernel code, 2276K rwdata, 8936K rodata, 39424K init, 1034K bss, 212156K reserved, 0K cma-reserved) May 27 17:00:21.113071 kernel: devtmpfs: initialized May 27 17:00:21.113090 kernel: clocksource: jiffies: mask: 0xffffffff max_cycles: 0xffffffff, max_idle_ns: 1911260446275000 ns May 27 17:00:21.113109 kernel: futex hash table entries: 512 (order: 3, 32768 bytes, linear) May 27 17:00:21.113132 kernel: 17024 pages in range for non-PLT usage May 27 17:00:21.113150 kernel: 508544 pages in range for PLT usage May 27 17:00:21.113169 kernel: pinctrl core: initialized pinctrl subsystem May 27 17:00:21.113187 kernel: SMBIOS 3.0.0 present. May 27 17:00:21.113206 kernel: DMI: Amazon EC2 a1.large/, BIOS 1.0 11/1/2018 May 27 17:00:21.113225 kernel: DMI: Memory slots populated: 0/0 May 27 17:00:21.113244 kernel: NET: Registered PF_NETLINK/PF_ROUTE protocol family May 27 17:00:21.113264 kernel: DMA: preallocated 512 KiB GFP_KERNEL pool for atomic allocations May 27 17:00:21.113282 kernel: DMA: preallocated 512 KiB GFP_KERNEL|GFP_DMA pool for atomic allocations May 27 17:00:21.113307 kernel: DMA: preallocated 512 KiB GFP_KERNEL|GFP_DMA32 pool for atomic allocations May 27 17:00:21.113325 kernel: audit: initializing netlink subsys (disabled) May 27 17:00:21.113344 kernel: audit: type=2000 audit(0.227:1): state=initialized audit_enabled=0 res=1 May 27 17:00:21.113362 kernel: thermal_sys: Registered thermal governor 'step_wise' May 27 17:00:21.113380 kernel: cpuidle: using governor menu May 27 17:00:21.113399 kernel: hw-breakpoint: found 6 breakpoint and 4 watchpoint registers. May 27 17:00:21.113418 kernel: ASID allocator initialised with 65536 entries May 27 17:00:21.113436 kernel: acpiphp: ACPI Hot Plug PCI Controller Driver version: 0.5 May 27 17:00:21.113459 kernel: Serial: AMBA PL011 UART driver May 27 17:00:21.113479 kernel: HugeTLB: registered 1.00 GiB page size, pre-allocated 0 pages May 27 17:00:21.113497 kernel: HugeTLB: 0 KiB vmemmap can be freed for a 1.00 GiB page May 27 17:00:21.113514 kernel: HugeTLB: registered 32.0 MiB page size, pre-allocated 0 pages May 27 17:00:21.113532 kernel: HugeTLB: 0 KiB vmemmap can be freed for a 32.0 MiB page May 27 17:00:21.113550 kernel: HugeTLB: registered 2.00 MiB page size, pre-allocated 0 pages May 27 17:00:21.113567 kernel: HugeTLB: 0 KiB vmemmap can be freed for a 2.00 MiB page May 27 17:00:21.113585 kernel: HugeTLB: registered 64.0 KiB page size, pre-allocated 0 pages May 27 17:00:21.113604 kernel: HugeTLB: 0 KiB vmemmap can be freed for a 64.0 KiB page May 27 17:00:21.113625 kernel: ACPI: Added _OSI(Module Device) May 27 17:00:21.113643 kernel: ACPI: Added _OSI(Processor Device) May 27 17:00:21.113661 kernel: ACPI: Added _OSI(3.0 _SCP Extensions) May 27 17:00:21.113679 kernel: ACPI: Added _OSI(Processor Aggregator Device) May 27 17:00:21.113696 kernel: ACPI: 1 ACPI AML tables successfully acquired and loaded May 27 17:00:21.113714 kernel: ACPI: Interpreter enabled May 27 17:00:21.113732 kernel: ACPI: Using GIC for interrupt routing May 27 17:00:21.113749 kernel: ACPI: MCFG table detected, 1 entries May 27 17:00:21.113767 kernel: ACPI: CPU0 has been hot-added May 27 17:00:21.113785 kernel: ACPI: CPU1 has been hot-added May 27 17:00:21.113810 kernel: ACPI: PCI Root Bridge [PCI0] (domain 0000 [bus 00-0f]) May 27 17:00:21.116324 kernel: acpi PNP0A08:00: _OSC: OS supports [ExtendedConfig ASPM ClockPM Segments MSI HPX-Type3] May 27 17:00:21.116617 kernel: acpi PNP0A08:00: _OSC: platform does not support [LTR] May 27 17:00:21.116885 kernel: acpi PNP0A08:00: _OSC: OS now controls [PCIeHotplug PME AER PCIeCapability] May 27 17:00:21.117207 kernel: acpi PNP0A08:00: ECAM area [mem 0x20000000-0x20ffffff] reserved by PNP0C02:00 May 27 17:00:21.117456 kernel: acpi PNP0A08:00: ECAM at [mem 0x20000000-0x20ffffff] for [bus 00-0f] May 27 17:00:21.117489 kernel: ACPI: Remapped I/O 0x000000001fff0000 to [io 0x0000-0xffff window] May 27 17:00:21.117519 kernel: acpiphp: Slot [1] registered May 27 17:00:21.117538 kernel: acpiphp: Slot [2] registered May 27 17:00:21.117556 kernel: acpiphp: Slot [3] registered May 27 17:00:21.117574 kernel: acpiphp: Slot [4] registered May 27 17:00:21.117592 kernel: acpiphp: Slot [5] registered May 27 17:00:21.117610 kernel: acpiphp: Slot [6] registered May 27 17:00:21.117629 kernel: acpiphp: Slot [7] registered May 27 17:00:21.117647 kernel: acpiphp: Slot [8] registered May 27 17:00:21.117664 kernel: acpiphp: Slot [9] registered May 27 17:00:21.117687 kernel: acpiphp: Slot [10] registered May 27 17:00:21.117706 kernel: acpiphp: Slot [11] registered May 27 17:00:21.117724 kernel: acpiphp: Slot [12] registered May 27 17:00:21.117742 kernel: acpiphp: Slot [13] registered May 27 17:00:21.117760 kernel: acpiphp: Slot [14] registered May 27 17:00:21.117778 kernel: acpiphp: Slot [15] registered May 27 17:00:21.117796 kernel: acpiphp: Slot [16] registered May 27 17:00:21.117814 kernel: acpiphp: Slot [17] registered May 27 17:00:21.117833 kernel: acpiphp: Slot [18] registered May 27 17:00:21.117851 kernel: acpiphp: Slot [19] registered May 27 17:00:21.117874 kernel: acpiphp: Slot [20] registered May 27 17:00:21.117893 kernel: acpiphp: Slot [21] registered May 27 17:00:21.117911 kernel: acpiphp: Slot [22] registered May 27 17:00:21.117929 kernel: acpiphp: Slot [23] registered May 27 17:00:21.120067 kernel: acpiphp: Slot [24] registered May 27 17:00:21.120099 kernel: acpiphp: Slot [25] registered May 27 17:00:21.120118 kernel: acpiphp: Slot [26] registered May 27 17:00:21.120137 kernel: acpiphp: Slot [27] registered May 27 17:00:21.120156 kernel: acpiphp: Slot [28] registered May 27 17:00:21.120186 kernel: acpiphp: Slot [29] registered May 27 17:00:21.120205 kernel: acpiphp: Slot [30] registered May 27 17:00:21.120223 kernel: acpiphp: Slot [31] registered May 27 17:00:21.120241 kernel: PCI host bridge to bus 0000:00 May 27 17:00:21.120525 kernel: pci_bus 0000:00: root bus resource [mem 0x80000000-0xffffffff window] May 27 17:00:21.122197 kernel: pci_bus 0000:00: root bus resource [io 0x0000-0xffff window] May 27 17:00:21.122420 kernel: pci_bus 0000:00: root bus resource [mem 0x400000000000-0x407fffffffff window] May 27 17:00:21.122656 kernel: pci_bus 0000:00: root bus resource [bus 00-0f] May 27 17:00:21.122923 kernel: pci 0000:00:00.0: [1d0f:0200] type 00 class 0x060000 conventional PCI endpoint May 27 17:00:21.123259 kernel: pci 0000:00:01.0: [1d0f:8250] type 00 class 0x070003 conventional PCI endpoint May 27 17:00:21.123490 kernel: pci 0000:00:01.0: BAR 0 [mem 0x80118000-0x80118fff] May 27 17:00:21.123722 kernel: pci 0000:00:04.0: [1d0f:8061] type 00 class 0x010802 PCIe Root Complex Integrated Endpoint May 27 17:00:21.127368 kernel: pci 0000:00:04.0: BAR 0 [mem 0x80114000-0x80117fff] May 27 17:00:21.127764 kernel: pci 0000:00:04.0: PME# supported from D0 D1 D2 D3hot D3cold May 27 17:00:21.130310 kernel: pci 0000:00:05.0: [1d0f:ec20] type 00 class 0x020000 PCIe Root Complex Integrated Endpoint May 27 17:00:21.130683 kernel: pci 0000:00:05.0: BAR 0 [mem 0x80110000-0x80113fff] May 27 17:00:21.131053 kernel: pci 0000:00:05.0: BAR 2 [mem 0x80000000-0x800fffff pref] May 27 17:00:21.131321 kernel: pci 0000:00:05.0: BAR 4 [mem 0x80100000-0x8010ffff] May 27 17:00:21.131571 kernel: pci 0000:00:05.0: PME# supported from D0 D1 D2 D3hot D3cold May 27 17:00:21.131801 kernel: pci 0000:00:05.0: BAR 2 [mem 0x80000000-0x800fffff pref]: assigned May 27 17:00:21.135140 kernel: pci 0000:00:05.0: BAR 4 [mem 0x80100000-0x8010ffff]: assigned May 27 17:00:21.135401 kernel: pci 0000:00:04.0: BAR 0 [mem 0x80110000-0x80113fff]: assigned May 27 17:00:21.135612 kernel: pci 0000:00:05.0: BAR 0 [mem 0x80114000-0x80117fff]: assigned May 27 17:00:21.135835 kernel: pci 0000:00:01.0: BAR 0 [mem 0x80118000-0x80118fff]: assigned May 27 17:00:21.136080 kernel: pci_bus 0000:00: resource 4 [mem 0x80000000-0xffffffff window] May 27 17:00:21.136274 kernel: pci_bus 0000:00: resource 5 [io 0x0000-0xffff window] May 27 17:00:21.136463 kernel: pci_bus 0000:00: resource 6 [mem 0x400000000000-0x407fffffffff window] May 27 17:00:21.136490 kernel: ACPI: PCI: Interrupt link GSI0 configured for IRQ 35 May 27 17:00:21.136520 kernel: ACPI: PCI: Interrupt link GSI1 configured for IRQ 36 May 27 17:00:21.136539 kernel: ACPI: PCI: Interrupt link GSI2 configured for IRQ 37 May 27 17:00:21.136558 kernel: ACPI: PCI: Interrupt link GSI3 configured for IRQ 38 May 27 17:00:21.136576 kernel: iommu: Default domain type: Translated May 27 17:00:21.136595 kernel: iommu: DMA domain TLB invalidation policy: strict mode May 27 17:00:21.136612 kernel: efivars: Registered efivars operations May 27 17:00:21.136630 kernel: vgaarb: loaded May 27 17:00:21.136648 kernel: clocksource: Switched to clocksource arch_sys_counter May 27 17:00:21.136667 kernel: VFS: Disk quotas dquot_6.6.0 May 27 17:00:21.136690 kernel: VFS: Dquot-cache hash table entries: 512 (order 0, 4096 bytes) May 27 17:00:21.136709 kernel: pnp: PnP ACPI init May 27 17:00:21.137011 kernel: system 00:00: [mem 0x20000000-0x2fffffff] could not be reserved May 27 17:00:21.137053 kernel: pnp: PnP ACPI: found 1 devices May 27 17:00:21.137072 kernel: NET: Registered PF_INET protocol family May 27 17:00:21.137091 kernel: IP idents hash table entries: 65536 (order: 7, 524288 bytes, linear) May 27 17:00:21.137111 kernel: tcp_listen_portaddr_hash hash table entries: 2048 (order: 3, 32768 bytes, linear) May 27 17:00:21.137130 kernel: Table-perturb hash table entries: 65536 (order: 6, 262144 bytes, linear) May 27 17:00:21.137161 kernel: TCP established hash table entries: 32768 (order: 6, 262144 bytes, linear) May 27 17:00:21.137184 kernel: TCP bind hash table entries: 32768 (order: 8, 1048576 bytes, linear) May 27 17:00:21.137203 kernel: TCP: Hash tables configured (established 32768 bind 32768) May 27 17:00:21.137221 kernel: UDP hash table entries: 2048 (order: 4, 65536 bytes, linear) May 27 17:00:21.137239 kernel: UDP-Lite hash table entries: 2048 (order: 4, 65536 bytes, linear) May 27 17:00:21.137258 kernel: NET: Registered PF_UNIX/PF_LOCAL protocol family May 27 17:00:21.137276 kernel: PCI: CLS 0 bytes, default 64 May 27 17:00:21.137295 kernel: kvm [1]: HYP mode not available May 27 17:00:21.137313 kernel: Initialise system trusted keyrings May 27 17:00:21.137337 kernel: workingset: timestamp_bits=39 max_order=20 bucket_order=0 May 27 17:00:21.137356 kernel: Key type asymmetric registered May 27 17:00:21.137375 kernel: Asymmetric key parser 'x509' registered May 27 17:00:21.137393 kernel: Block layer SCSI generic (bsg) driver version 0.4 loaded (major 249) May 27 17:00:21.137412 kernel: io scheduler mq-deadline registered May 27 17:00:21.137431 kernel: io scheduler kyber registered May 27 17:00:21.137450 kernel: io scheduler bfq registered May 27 17:00:21.137737 kernel: pl061_gpio ARMH0061:00: PL061 GPIO chip registered May 27 17:00:21.137777 kernel: input: Power Button as /devices/LNXSYSTM:00/LNXSYBUS:00/PNP0C0C:00/input/input0 May 27 17:00:21.137803 kernel: ACPI: button: Power Button [PWRB] May 27 17:00:21.137822 kernel: input: Sleep Button as /devices/LNXSYSTM:00/LNXSYBUS:00/PNP0C0E:00/input/input1 May 27 17:00:21.137841 kernel: ACPI: button: Sleep Button [SLPB] May 27 17:00:21.137859 kernel: Serial: 8250/16550 driver, 4 ports, IRQ sharing enabled May 27 17:00:21.137878 kernel: ACPI: \_SB_.PCI0.GSI2: Enabled at IRQ 37 May 27 17:00:21.138162 kernel: serial 0000:00:01.0: enabling device (0010 -> 0012) May 27 17:00:21.138196 kernel: printk: legacy console [ttyS0] disabled May 27 17:00:21.138215 kernel: 0000:00:01.0: ttyS0 at MMIO 0x80118000 (irq = 14, base_baud = 115200) is a 16550A May 27 17:00:21.138242 kernel: printk: legacy console [ttyS0] enabled May 27 17:00:21.138261 kernel: printk: legacy bootconsole [uart0] disabled May 27 17:00:21.138279 kernel: thunder_xcv, ver 1.0 May 27 17:00:21.138297 kernel: thunder_bgx, ver 1.0 May 27 17:00:21.138315 kernel: nicpf, ver 1.0 May 27 17:00:21.138333 kernel: nicvf, ver 1.0 May 27 17:00:21.138602 kernel: rtc-efi rtc-efi.0: registered as rtc0 May 27 17:00:21.138818 kernel: rtc-efi rtc-efi.0: setting system clock to 2025-05-27T17:00:20 UTC (1748365220) May 27 17:00:21.138849 kernel: hid: raw HID events driver (C) Jiri Kosina May 27 17:00:21.138879 kernel: hw perfevents: enabled with armv8_pmuv3_0 PMU driver, 3 (0,80000003) counters available May 27 17:00:21.138899 kernel: NET: Registered PF_INET6 protocol family May 27 17:00:21.138917 kernel: watchdog: NMI not fully supported May 27 17:00:21.138935 kernel: watchdog: Hard watchdog permanently disabled May 27 17:00:21.141033 kernel: Segment Routing with IPv6 May 27 17:00:21.141055 kernel: In-situ OAM (IOAM) with IPv6 May 27 17:00:21.141075 kernel: NET: Registered PF_PACKET protocol family May 27 17:00:21.141093 kernel: Key type dns_resolver registered May 27 17:00:21.141112 kernel: registered taskstats version 1 May 27 17:00:21.141142 kernel: Loading compiled-in X.509 certificates May 27 17:00:21.141161 kernel: Loaded X.509 cert 'Kinvolk GmbH: Module signing key for 6.12.30-flatcar: 8e5e45c34fa91568ef1fa3bdfd5a71a43b4c4580' May 27 17:00:21.141179 kernel: Demotion targets for Node 0: null May 27 17:00:21.141198 kernel: Key type .fscrypt registered May 27 17:00:21.141218 kernel: Key type fscrypt-provisioning registered May 27 17:00:21.141239 kernel: ima: No TPM chip found, activating TPM-bypass! May 27 17:00:21.141258 kernel: ima: Allocated hash algorithm: sha1 May 27 17:00:21.141278 kernel: ima: No architecture policies found May 27 17:00:21.141297 kernel: alg: No test for fips(ansi_cprng) (fips_ansi_cprng) May 27 17:00:21.141324 kernel: clk: Disabling unused clocks May 27 17:00:21.141343 kernel: PM: genpd: Disabling unused power domains May 27 17:00:21.141363 kernel: Warning: unable to open an initial console. May 27 17:00:21.141382 kernel: Freeing unused kernel memory: 39424K May 27 17:00:21.141400 kernel: Run /init as init process May 27 17:00:21.141419 kernel: with arguments: May 27 17:00:21.141438 kernel: /init May 27 17:00:21.141457 kernel: with environment: May 27 17:00:21.141475 kernel: HOME=/ May 27 17:00:21.141502 kernel: TERM=linux May 27 17:00:21.141522 kernel: BOOT_IMAGE=/flatcar/vmlinuz-a May 27 17:00:21.141544 systemd[1]: Successfully made /usr/ read-only. May 27 17:00:21.141571 systemd[1]: systemd 256.8 running in system mode (+PAM +AUDIT +SELINUX -APPARMOR +IMA +SMACK +SECCOMP -GCRYPT -GNUTLS +OPENSSL -ACL +BLKID +CURL +ELFUTILS -FIDO2 +IDN2 -IDN +IPTC +KMOD +LIBCRYPTSETUP +LIBCRYPTSETUP_PLUGINS +LIBFDISK +PCRE2 -PWQUALITY -P11KIT -QRENCODE +TPM2 +BZIP2 +LZ4 +XZ +ZLIB +ZSTD -BPF_FRAMEWORK -XKBCOMMON +UTMP -SYSVINIT +LIBARCHIVE) May 27 17:00:21.141593 systemd[1]: Detected virtualization amazon. May 27 17:00:21.141614 systemd[1]: Detected architecture arm64. May 27 17:00:21.141634 systemd[1]: Running in initrd. May 27 17:00:21.141660 systemd[1]: No hostname configured, using default hostname. May 27 17:00:21.141681 systemd[1]: Hostname set to . May 27 17:00:21.141701 systemd[1]: Initializing machine ID from VM UUID. May 27 17:00:21.141720 systemd[1]: Queued start job for default target initrd.target. May 27 17:00:21.141740 systemd[1]: Started clevis-luks-askpass.path - Forward Password Requests to Clevis Directory Watch. May 27 17:00:21.141760 systemd[1]: Started systemd-ask-password-console.path - Dispatch Password Requests to Console Directory Watch. May 27 17:00:21.141782 systemd[1]: Expecting device dev-disk-by\x2dlabel-EFI\x2dSYSTEM.device - /dev/disk/by-label/EFI-SYSTEM... May 27 17:00:21.141804 systemd[1]: Expecting device dev-disk-by\x2dlabel-OEM.device - /dev/disk/by-label/OEM... May 27 17:00:21.141831 systemd[1]: Expecting device dev-disk-by\x2dlabel-ROOT.device - /dev/disk/by-label/ROOT... May 27 17:00:21.141853 systemd[1]: Expecting device dev-disk-by\x2dpartlabel-USR\x2dA.device - /dev/disk/by-partlabel/USR-A... May 27 17:00:21.141876 systemd[1]: Expecting device dev-disk-by\x2dpartuuid-7130c94a\x2d213a\x2d4e5a\x2d8e26\x2d6cce9662f132.device - /dev/disk/by-partuuid/7130c94a-213a-4e5a-8e26-6cce9662f132... May 27 17:00:21.141897 systemd[1]: Expecting device dev-mapper-usr.device - /dev/mapper/usr... May 27 17:00:21.141917 systemd[1]: Reached target cryptsetup-pre.target - Local Encrypted Volumes (Pre). May 27 17:00:21.141977 systemd[1]: Reached target cryptsetup.target - Local Encrypted Volumes. May 27 17:00:21.142009 systemd[1]: Reached target paths.target - Path Units. May 27 17:00:21.142040 systemd[1]: Reached target slices.target - Slice Units. May 27 17:00:21.142060 systemd[1]: Reached target swap.target - Swaps. May 27 17:00:21.142080 systemd[1]: Reached target timers.target - Timer Units. May 27 17:00:21.142101 systemd[1]: Listening on iscsid.socket - Open-iSCSI iscsid Socket. May 27 17:00:21.142121 systemd[1]: Listening on iscsiuio.socket - Open-iSCSI iscsiuio Socket. May 27 17:00:21.142141 systemd[1]: Listening on systemd-journald-dev-log.socket - Journal Socket (/dev/log). May 27 17:00:21.142161 systemd[1]: Listening on systemd-journald.socket - Journal Sockets. May 27 17:00:21.142182 systemd[1]: Listening on systemd-networkd.socket - Network Service Netlink Socket. May 27 17:00:21.142202 systemd[1]: Listening on systemd-udevd-control.socket - udev Control Socket. May 27 17:00:21.142228 systemd[1]: Listening on systemd-udevd-kernel.socket - udev Kernel Socket. May 27 17:00:21.142248 systemd[1]: Reached target sockets.target - Socket Units. May 27 17:00:21.142267 systemd[1]: Starting ignition-setup-pre.service - Ignition env setup... May 27 17:00:21.142287 systemd[1]: Starting kmod-static-nodes.service - Create List of Static Device Nodes... May 27 17:00:21.142307 systemd[1]: Finished network-cleanup.service - Network Cleanup. May 27 17:00:21.142327 systemd[1]: systemd-battery-check.service - Check battery level during early boot was skipped because of an unmet condition check (ConditionDirectoryNotEmpty=/sys/class/power_supply). May 27 17:00:21.142347 systemd[1]: Starting systemd-fsck-usr.service... May 27 17:00:21.142367 systemd[1]: Starting systemd-journald.service - Journal Service... May 27 17:00:21.142392 systemd[1]: Starting systemd-modules-load.service - Load Kernel Modules... May 27 17:00:21.142413 systemd[1]: Starting systemd-vconsole-setup.service - Virtual Console Setup... May 27 17:00:21.142460 systemd[1]: Finished ignition-setup-pre.service - Ignition env setup. May 27 17:00:21.142485 systemd[1]: Finished kmod-static-nodes.service - Create List of Static Device Nodes. May 27 17:00:21.142505 systemd[1]: Finished systemd-fsck-usr.service. May 27 17:00:21.142534 systemd[1]: Starting systemd-tmpfiles-setup-dev-early.service - Create Static Device Nodes in /dev gracefully... May 27 17:00:21.142611 systemd-journald[257]: Collecting audit messages is disabled. May 27 17:00:21.142661 systemd[1]: Finished systemd-vconsole-setup.service - Virtual Console Setup. May 27 17:00:21.142689 kernel: bridge: filtering via arp/ip/ip6tables is no longer available by default. Update your scripts to load br_netfilter if you need this. May 27 17:00:21.142711 systemd[1]: Starting dracut-cmdline-ask.service - dracut ask for additional cmdline parameters... May 27 17:00:21.142749 systemd-journald[257]: Journal started May 27 17:00:21.142791 systemd-journald[257]: Runtime Journal (/run/log/journal/ec2efc5f08f7323a9d4d518f12e3a5de) is 8M, max 75.3M, 67.3M free. May 27 17:00:21.090059 systemd-modules-load[259]: Inserted module 'overlay' May 27 17:00:21.151093 kernel: Bridge firewalling registered May 27 17:00:21.151136 systemd[1]: Started systemd-journald.service - Journal Service. May 27 17:00:21.149919 systemd-modules-load[259]: Inserted module 'br_netfilter' May 27 17:00:21.158036 systemd[1]: Finished systemd-modules-load.service - Load Kernel Modules. May 27 17:00:21.162314 systemd[1]: Finished systemd-tmpfiles-setup-dev-early.service - Create Static Device Nodes in /dev gracefully. May 27 17:00:21.176558 systemd[1]: Starting systemd-sysctl.service - Apply Kernel Variables... May 27 17:00:21.187443 systemd[1]: Starting systemd-tmpfiles-setup-dev.service - Create Static Device Nodes in /dev... May 27 17:00:21.202889 systemd[1]: Starting systemd-tmpfiles-setup.service - Create System Files and Directories... May 27 17:00:21.219048 systemd[1]: Finished systemd-sysctl.service - Apply Kernel Variables. May 27 17:00:21.234231 systemd[1]: Finished systemd-tmpfiles-setup-dev.service - Create Static Device Nodes in /dev. May 27 17:00:21.240382 systemd[1]: Finished dracut-cmdline-ask.service - dracut ask for additional cmdline parameters. May 27 17:00:21.248565 systemd-tmpfiles[285]: /usr/lib/tmpfiles.d/var.conf:14: Duplicate line for path "/var/log", ignoring. May 27 17:00:21.259814 systemd[1]: Starting dracut-cmdline.service - dracut cmdline hook... May 27 17:00:21.266057 systemd[1]: Finished systemd-tmpfiles-setup.service - Create System Files and Directories. May 27 17:00:21.282855 systemd[1]: Starting systemd-resolved.service - Network Name Resolution... May 27 17:00:21.314235 dracut-cmdline[296]: Using kernel command line parameters: rd.driver.pre=btrfs SYSTEMD_SULOGIN_FORCE=1 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=4e706b869299e1c88703222069cdfa08c45ebce568f762053eea5b3f5f0939c3 May 27 17:00:21.393152 systemd-resolved[298]: Positive Trust Anchors: May 27 17:00:21.393192 systemd-resolved[298]: . IN DS 20326 8 2 e06d44b80b8f1d39a95c0b0d7c65d08458e880409bbc683457104237c7f8ec8d May 27 17:00:21.393256 systemd-resolved[298]: 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 May 27 17:00:21.499988 kernel: SCSI subsystem initialized May 27 17:00:21.507991 kernel: Loading iSCSI transport class v2.0-870. May 27 17:00:21.521244 kernel: iscsi: registered transport (tcp) May 27 17:00:21.544196 kernel: iscsi: registered transport (qla4xxx) May 27 17:00:21.544272 kernel: QLogic iSCSI HBA Driver May 27 17:00:21.584222 systemd[1]: Starting systemd-network-generator.service - Generate network units from Kernel command line... May 27 17:00:21.623032 systemd[1]: Finished systemd-network-generator.service - Generate network units from Kernel command line. May 27 17:00:21.630801 systemd[1]: Reached target network-pre.target - Preparation for Network. May 27 17:00:21.663835 kernel: random: crng init done May 27 17:00:21.663336 systemd-resolved[298]: Defaulting to hostname 'linux'. May 27 17:00:21.667147 systemd[1]: Started systemd-resolved.service - Network Name Resolution. May 27 17:00:21.672214 systemd[1]: Reached target nss-lookup.target - Host and Network Name Lookups. May 27 17:00:21.743312 systemd[1]: Finished dracut-cmdline.service - dracut cmdline hook. May 27 17:00:21.750479 systemd[1]: Starting dracut-pre-udev.service - dracut pre-udev hook... May 27 17:00:21.843011 kernel: raid6: neonx8 gen() 6309 MB/s May 27 17:00:21.860006 kernel: raid6: neonx4 gen() 6366 MB/s May 27 17:00:21.877008 kernel: raid6: neonx2 gen() 5324 MB/s May 27 17:00:21.893992 kernel: raid6: neonx1 gen() 3887 MB/s May 27 17:00:21.911004 kernel: raid6: int64x8 gen() 3583 MB/s May 27 17:00:21.928008 kernel: raid6: int64x4 gen() 3663 MB/s May 27 17:00:21.945005 kernel: raid6: int64x2 gen() 3536 MB/s May 27 17:00:21.962891 kernel: raid6: int64x1 gen() 2739 MB/s May 27 17:00:21.962994 kernel: raid6: using algorithm neonx4 gen() 6366 MB/s May 27 17:00:21.980865 kernel: raid6: .... xor() 4813 MB/s, rmw enabled May 27 17:00:21.980978 kernel: raid6: using neon recovery algorithm May 27 17:00:21.989001 kernel: xor: measuring software checksum speed May 27 17:00:21.989079 kernel: 8regs : 11546 MB/sec May 27 17:00:21.992345 kernel: 32regs : 11299 MB/sec May 27 17:00:21.992422 kernel: arm64_neon : 8880 MB/sec May 27 17:00:21.992448 kernel: xor: using function: 8regs (11546 MB/sec) May 27 17:00:22.091994 kernel: Btrfs loaded, zoned=no, fsverity=no May 27 17:00:22.104352 systemd[1]: Finished dracut-pre-udev.service - dracut pre-udev hook. May 27 17:00:22.111857 systemd[1]: Starting systemd-udevd.service - Rule-based Manager for Device Events and Files... May 27 17:00:22.167162 systemd-udevd[506]: Using default interface naming scheme 'v255'. May 27 17:00:22.178717 systemd[1]: Started systemd-udevd.service - Rule-based Manager for Device Events and Files. May 27 17:00:22.184208 systemd[1]: Starting dracut-pre-trigger.service - dracut pre-trigger hook... May 27 17:00:22.231507 dracut-pre-trigger[510]: rd.md=0: removing MD RAID activation May 27 17:00:22.281765 systemd[1]: Finished dracut-pre-trigger.service - dracut pre-trigger hook. May 27 17:00:22.288807 systemd[1]: Starting systemd-udev-trigger.service - Coldplug All udev Devices... May 27 17:00:22.432569 systemd[1]: Finished systemd-udev-trigger.service - Coldplug All udev Devices. May 27 17:00:22.442695 systemd[1]: Starting dracut-initqueue.service - dracut initqueue hook... May 27 17:00:22.611970 kernel: ACPI: \_SB_.PCI0.GSI1: Enabled at IRQ 36 May 27 17:00:22.612070 kernel: ena 0000:00:05.0: enabling device (0010 -> 0012) May 27 17:00:22.623189 kernel: ena 0000:00:05.0: ENA device version: 0.10 May 27 17:00:22.623884 kernel: ena 0000:00:05.0: ENA controller version: 0.0.1 implementation version 1 May 27 17:00:22.638986 kernel: ACPI: \_SB_.PCI0.GSI0: Enabled at IRQ 35 May 27 17:00:22.639073 kernel: ena 0000:00:05.0: Elastic Network Adapter (ENA) found at mem 80114000, mac addr 06:53:b2:55:0b:75 May 27 17:00:22.640617 kernel: nvme nvme0: pci function 0000:00:04.0 May 27 17:00:22.650563 kernel: nvme nvme0: 2/0/0 default/read/poll queues May 27 17:00:22.657978 kernel: GPT:Primary header thinks Alt. header is not at the end of the disk. May 27 17:00:22.658062 kernel: GPT:9289727 != 16777215 May 27 17:00:22.659285 kernel: GPT:Alternate GPT header not at the end of the disk. May 27 17:00:22.660078 kernel: GPT:9289727 != 16777215 May 27 17:00:22.661285 kernel: GPT: Use GNU Parted to correct GPT errors. May 27 17:00:22.662234 kernel: nvme0n1: p1 p2 p3 p4 p6 p7 p9 May 27 17:00:22.671725 (udev-worker)[568]: Network interface NamePolicy= disabled on kernel command line. May 27 17:00:22.690307 systemd[1]: systemd-vconsole-setup.service: Deactivated successfully. May 27 17:00:22.692822 systemd[1]: Stopped systemd-vconsole-setup.service - Virtual Console Setup. May 27 17:00:22.695500 systemd[1]: Stopping systemd-vconsole-setup.service - Virtual Console Setup... May 27 17:00:22.704531 systemd[1]: Starting systemd-vconsole-setup.service - Virtual Console Setup... May 27 17:00:22.715215 systemd[1]: run-credentials-systemd\x2dvconsole\x2dsetup.service.mount: Deactivated successfully. May 27 17:00:22.736829 kernel: nvme nvme0: using unchecked data buffer May 27 17:00:22.760896 systemd[1]: Finished systemd-vconsole-setup.service - Virtual Console Setup. May 27 17:00:22.875112 systemd[1]: Found device dev-disk-by\x2dlabel-EFI\x2dSYSTEM.device - Amazon Elastic Block Store EFI-SYSTEM. May 27 17:00:22.933973 systemd[1]: Found device dev-disk-by\x2dpartlabel-USR\x2dA.device - Amazon Elastic Block Store USR-A. May 27 17:00:22.935347 systemd[1]: Found device dev-disk-by\x2dpartuuid-7130c94a\x2d213a\x2d4e5a\x2d8e26\x2d6cce9662f132.device - Amazon Elastic Block Store USR-A. May 27 17:00:22.981580 systemd[1]: Finished dracut-initqueue.service - dracut initqueue hook. May 27 17:00:23.008268 systemd[1]: Found device dev-disk-by\x2dlabel-OEM.device - Amazon Elastic Block Store OEM. May 27 17:00:23.038117 systemd[1]: Found device dev-disk-by\x2dlabel-ROOT.device - Amazon Elastic Block Store ROOT. May 27 17:00:23.044324 systemd[1]: Reached target remote-fs-pre.target - Preparation for Remote File Systems. May 27 17:00:23.047130 systemd[1]: Reached target remote-cryptsetup.target - Remote Encrypted Volumes. May 27 17:00:23.050063 systemd[1]: Reached target remote-fs.target - Remote File Systems. May 27 17:00:23.061496 systemd[1]: Starting disk-uuid.service - Generate new UUID for disk GPT if necessary... May 27 17:00:23.069710 systemd[1]: Starting dracut-pre-mount.service - dracut pre-mount hook... May 27 17:00:23.093999 disk-uuid[685]: Primary Header is updated. May 27 17:00:23.093999 disk-uuid[685]: Secondary Entries is updated. May 27 17:00:23.093999 disk-uuid[685]: Secondary Header is updated. May 27 17:00:23.104195 kernel: nvme0n1: p1 p2 p3 p4 p6 p7 p9 May 27 17:00:23.117337 systemd[1]: Finished dracut-pre-mount.service - dracut pre-mount hook. May 27 17:00:23.122203 kernel: nvme0n1: p1 p2 p3 p4 p6 p7 p9 May 27 17:00:24.130042 kernel: nvme0n1: p1 p2 p3 p4 p6 p7 p9 May 27 17:00:24.131567 disk-uuid[688]: The operation has completed successfully. May 27 17:00:24.368466 systemd[1]: disk-uuid.service: Deactivated successfully. May 27 17:00:24.370569 systemd[1]: Finished disk-uuid.service - Generate new UUID for disk GPT if necessary. May 27 17:00:24.435890 systemd[1]: Starting verity-setup.service - Verity Setup for /dev/mapper/usr... May 27 17:00:24.457806 sh[953]: Success May 27 17:00:24.487830 kernel: device-mapper: core: CONFIG_IMA_DISABLE_HTABLE is disabled. Duplicate IMA measurements will not be recorded in the IMA log. May 27 17:00:24.487984 kernel: device-mapper: uevent: version 1.0.3 May 27 17:00:24.488033 kernel: device-mapper: ioctl: 4.48.0-ioctl (2023-03-01) initialised: dm-devel@lists.linux.dev May 27 17:00:24.502988 kernel: device-mapper: verity: sha256 using shash "sha256-ce" May 27 17:00:24.624241 systemd[1]: Found device dev-mapper-usr.device - /dev/mapper/usr. May 27 17:00:24.633669 systemd[1]: Mounting sysusr-usr.mount - /sysusr/usr... May 27 17:00:24.658780 systemd[1]: Finished verity-setup.service - Verity Setup for /dev/mapper/usr. May 27 17:00:24.683030 kernel: BTRFS info: 'norecovery' is for compatibility only, recommended to use 'rescue=nologreplay' May 27 17:00:24.685981 kernel: BTRFS: device fsid 3c8c76ef-f1da-40fe-979d-11bdf765e403 devid 1 transid 39 /dev/mapper/usr (254:0) scanned by mount (977) May 27 17:00:24.690724 kernel: BTRFS info (device dm-0): first mount of filesystem 3c8c76ef-f1da-40fe-979d-11bdf765e403 May 27 17:00:24.690825 kernel: BTRFS info (device dm-0): using crc32c (crc32c-generic) checksum algorithm May 27 17:00:24.690854 kernel: BTRFS info (device dm-0): using free-space-tree May 27 17:00:24.739336 systemd[1]: Mounted sysusr-usr.mount - /sysusr/usr. May 27 17:00:24.743423 systemd[1]: Reached target initrd-usr-fs.target - Initrd /usr File System. May 27 17:00:24.748146 systemd[1]: afterburn-network-kargs.service - Afterburn Initrd Setup Network Kernel Arguments was skipped because no trigger condition checks were met. May 27 17:00:24.753209 systemd[1]: Starting ignition-setup.service - Ignition (setup)... May 27 17:00:24.760286 systemd[1]: Starting parse-ip-for-networkd.service - Write systemd-networkd units from cmdline... May 27 17:00:24.827003 kernel: BTRFS: device label OEM devid 1 transid 15 /dev/nvme0n1p6 (259:3) scanned by mount (1012) May 27 17:00:24.832609 kernel: BTRFS info (device nvme0n1p6): first mount of filesystem 0631e8fb-ef71-4ba1-b2b8-88386996a754 May 27 17:00:24.832693 kernel: BTRFS info (device nvme0n1p6): using crc32c (crc32c-generic) checksum algorithm May 27 17:00:24.833968 kernel: BTRFS info (device nvme0n1p6): using free-space-tree May 27 17:00:24.861041 kernel: BTRFS info (device nvme0n1p6): last unmount of filesystem 0631e8fb-ef71-4ba1-b2b8-88386996a754 May 27 17:00:24.864431 systemd[1]: Finished ignition-setup.service - Ignition (setup). May 27 17:00:24.869881 systemd[1]: Starting ignition-fetch-offline.service - Ignition (fetch-offline)... May 27 17:00:24.972105 systemd[1]: Finished parse-ip-for-networkd.service - Write systemd-networkd units from cmdline. May 27 17:00:24.980014 systemd[1]: Starting systemd-networkd.service - Network Configuration... May 27 17:00:25.085206 systemd-networkd[1147]: lo: Link UP May 27 17:00:25.085223 systemd-networkd[1147]: lo: Gained carrier May 27 17:00:25.093591 systemd-networkd[1147]: Enumeration completed May 27 17:00:25.093782 systemd[1]: Started systemd-networkd.service - Network Configuration. May 27 17:00:25.096848 systemd-networkd[1147]: eth0: found matching network '/usr/lib/systemd/network/zz-default.network', based on potentially unpredictable interface name. May 27 17:00:25.096857 systemd-networkd[1147]: eth0: Configuring with /usr/lib/systemd/network/zz-default.network. May 27 17:00:25.099045 systemd[1]: Reached target network.target - Network. May 27 17:00:25.112725 systemd-networkd[1147]: eth0: Link UP May 27 17:00:25.112746 systemd-networkd[1147]: eth0: Gained carrier May 27 17:00:25.112771 systemd-networkd[1147]: eth0: found matching network '/usr/lib/systemd/network/zz-default.network', based on potentially unpredictable interface name. May 27 17:00:25.127104 systemd-networkd[1147]: eth0: DHCPv4 address 172.31.23.127/20, gateway 172.31.16.1 acquired from 172.31.16.1 May 27 17:00:25.170655 ignition[1080]: Ignition 2.21.0 May 27 17:00:25.171264 ignition[1080]: Stage: fetch-offline May 27 17:00:25.171757 ignition[1080]: no configs at "/usr/lib/ignition/base.d" May 27 17:00:25.171782 ignition[1080]: no config dir at "/usr/lib/ignition/base.platform.d/aws" May 27 17:00:25.176866 systemd[1]: Finished ignition-fetch-offline.service - Ignition (fetch-offline). May 27 17:00:25.172399 ignition[1080]: Ignition finished successfully May 27 17:00:25.183244 systemd[1]: Starting ignition-fetch.service - Ignition (fetch)... May 27 17:00:25.224031 ignition[1158]: Ignition 2.21.0 May 27 17:00:25.224550 ignition[1158]: Stage: fetch May 27 17:00:25.225198 ignition[1158]: no configs at "/usr/lib/ignition/base.d" May 27 17:00:25.225227 ignition[1158]: no config dir at "/usr/lib/ignition/base.platform.d/aws" May 27 17:00:25.225464 ignition[1158]: PUT http://169.254.169.254/latest/api/token: attempt #1 May 27 17:00:25.252227 ignition[1158]: PUT result: OK May 27 17:00:25.257380 ignition[1158]: parsed url from cmdline: "" May 27 17:00:25.257448 ignition[1158]: no config URL provided May 27 17:00:25.257464 ignition[1158]: reading system config file "/usr/lib/ignition/user.ign" May 27 17:00:25.257493 ignition[1158]: no config at "/usr/lib/ignition/user.ign" May 27 17:00:25.257881 ignition[1158]: PUT http://169.254.169.254/latest/api/token: attempt #1 May 27 17:00:25.261816 ignition[1158]: PUT result: OK May 27 17:00:25.262050 ignition[1158]: GET http://169.254.169.254/2019-10-01/user-data: attempt #1 May 27 17:00:25.268655 ignition[1158]: GET result: OK May 27 17:00:25.268762 ignition[1158]: parsing config with SHA512: 1ce44adf44ca73c7310b738ec1f6bbaca0f95c0847dbaf59d7b80be11d8e9735a85aef64241953ba3697d27ad12f733c9976d6787d168be9f35b67a03314e541 May 27 17:00:25.281719 unknown[1158]: fetched base config from "system" May 27 17:00:25.282377 unknown[1158]: fetched base config from "system" May 27 17:00:25.283614 ignition[1158]: fetch: fetch complete May 27 17:00:25.282392 unknown[1158]: fetched user config from "aws" May 27 17:00:25.283630 ignition[1158]: fetch: fetch passed May 27 17:00:25.283745 ignition[1158]: Ignition finished successfully May 27 17:00:25.293627 systemd[1]: Finished ignition-fetch.service - Ignition (fetch). May 27 17:00:25.299210 systemd[1]: Starting ignition-kargs.service - Ignition (kargs)... May 27 17:00:25.341899 ignition[1165]: Ignition 2.21.0 May 27 17:00:25.341963 ignition[1165]: Stage: kargs May 27 17:00:25.343268 ignition[1165]: no configs at "/usr/lib/ignition/base.d" May 27 17:00:25.343574 ignition[1165]: no config dir at "/usr/lib/ignition/base.platform.d/aws" May 27 17:00:25.343742 ignition[1165]: PUT http://169.254.169.254/latest/api/token: attempt #1 May 27 17:00:25.345745 ignition[1165]: PUT result: OK May 27 17:00:25.363479 ignition[1165]: kargs: kargs passed May 27 17:00:25.363596 ignition[1165]: Ignition finished successfully May 27 17:00:25.368611 systemd[1]: Finished ignition-kargs.service - Ignition (kargs). May 27 17:00:25.375249 systemd[1]: Starting ignition-disks.service - Ignition (disks)... May 27 17:00:25.428899 ignition[1171]: Ignition 2.21.0 May 27 17:00:25.428970 ignition[1171]: Stage: disks May 27 17:00:25.429826 ignition[1171]: no configs at "/usr/lib/ignition/base.d" May 27 17:00:25.429854 ignition[1171]: no config dir at "/usr/lib/ignition/base.platform.d/aws" May 27 17:00:25.430228 ignition[1171]: PUT http://169.254.169.254/latest/api/token: attempt #1 May 27 17:00:25.432403 ignition[1171]: PUT result: OK May 27 17:00:25.445301 ignition[1171]: disks: disks passed May 27 17:00:25.445429 ignition[1171]: Ignition finished successfully May 27 17:00:25.449664 systemd[1]: Finished ignition-disks.service - Ignition (disks). May 27 17:00:25.454288 systemd[1]: Reached target initrd-root-device.target - Initrd Root Device. May 27 17:00:25.458805 systemd[1]: Reached target local-fs-pre.target - Preparation for Local File Systems. May 27 17:00:25.463831 systemd[1]: Reached target local-fs.target - Local File Systems. May 27 17:00:25.467103 systemd[1]: Reached target sysinit.target - System Initialization. May 27 17:00:25.471681 systemd[1]: Reached target basic.target - Basic System. May 27 17:00:25.476843 systemd[1]: Starting systemd-fsck-root.service - File System Check on /dev/disk/by-label/ROOT... May 27 17:00:25.534113 systemd-fsck[1179]: ROOT: clean, 15/553520 files, 52789/553472 blocks May 27 17:00:25.543203 systemd[1]: Finished systemd-fsck-root.service - File System Check on /dev/disk/by-label/ROOT. May 27 17:00:25.550086 systemd[1]: Mounting sysroot.mount - /sysroot... May 27 17:00:25.678011 kernel: EXT4-fs (nvme0n1p9): mounted filesystem a5483afc-8426-4c3e-85ef-8146f9077e7d r/w with ordered data mode. Quota mode: none. May 27 17:00:25.678516 systemd[1]: Mounted sysroot.mount - /sysroot. May 27 17:00:25.682165 systemd[1]: Reached target initrd-root-fs.target - Initrd Root File System. May 27 17:00:25.688369 systemd[1]: Mounting sysroot-oem.mount - /sysroot/oem... May 27 17:00:25.693608 systemd[1]: Mounting sysroot-usr.mount - /sysroot/usr... May 27 17:00:25.700130 systemd[1]: flatcar-metadata-hostname.service - Flatcar Metadata Hostname Agent was skipped because no trigger condition checks were met. May 27 17:00:25.700231 systemd[1]: ignition-remount-sysroot.service - Remount /sysroot read-write for Ignition was skipped because of an unmet condition check (ConditionPathIsReadWrite=!/sysroot). May 27 17:00:25.700284 systemd[1]: Reached target ignition-diskful.target - Ignition Boot Disk Setup. May 27 17:00:25.724168 systemd[1]: Mounted sysroot-usr.mount - /sysroot/usr. May 27 17:00:25.731209 systemd[1]: Starting initrd-setup-root.service - Root filesystem setup... May 27 17:00:25.745980 kernel: BTRFS: device label OEM devid 1 transid 15 /dev/nvme0n1p6 (259:3) scanned by mount (1198) May 27 17:00:25.750135 kernel: BTRFS info (device nvme0n1p6): first mount of filesystem 0631e8fb-ef71-4ba1-b2b8-88386996a754 May 27 17:00:25.750204 kernel: BTRFS info (device nvme0n1p6): using crc32c (crc32c-generic) checksum algorithm May 27 17:00:25.750231 kernel: BTRFS info (device nvme0n1p6): using free-space-tree May 27 17:00:25.764315 systemd[1]: Mounted sysroot-oem.mount - /sysroot/oem. May 27 17:00:25.874460 initrd-setup-root[1222]: cut: /sysroot/etc/passwd: No such file or directory May 27 17:00:25.885986 initrd-setup-root[1229]: cut: /sysroot/etc/group: No such file or directory May 27 17:00:25.897370 initrd-setup-root[1236]: cut: /sysroot/etc/shadow: No such file or directory May 27 17:00:25.906914 initrd-setup-root[1243]: cut: /sysroot/etc/gshadow: No such file or directory May 27 17:00:26.103762 systemd[1]: Finished initrd-setup-root.service - Root filesystem setup. May 27 17:00:26.111384 systemd[1]: Starting ignition-mount.service - Ignition (mount)... May 27 17:00:26.124239 systemd[1]: Starting sysroot-boot.service - /sysroot/boot... May 27 17:00:26.153161 systemd[1]: sysroot-oem.mount: Deactivated successfully. May 27 17:00:26.156285 kernel: BTRFS info (device nvme0n1p6): last unmount of filesystem 0631e8fb-ef71-4ba1-b2b8-88386996a754 May 27 17:00:26.186014 systemd[1]: Finished sysroot-boot.service - /sysroot/boot. May 27 17:00:26.209724 ignition[1311]: INFO : Ignition 2.21.0 May 27 17:00:26.209724 ignition[1311]: INFO : Stage: mount May 27 17:00:26.214161 ignition[1311]: INFO : no configs at "/usr/lib/ignition/base.d" May 27 17:00:26.214161 ignition[1311]: INFO : no config dir at "/usr/lib/ignition/base.platform.d/aws" May 27 17:00:26.214161 ignition[1311]: INFO : PUT http://169.254.169.254/latest/api/token: attempt #1 May 27 17:00:26.231192 ignition[1311]: INFO : PUT result: OK May 27 17:00:26.235679 ignition[1311]: INFO : mount: mount passed May 27 17:00:26.237327 ignition[1311]: INFO : Ignition finished successfully May 27 17:00:26.241027 systemd[1]: Finished ignition-mount.service - Ignition (mount). May 27 17:00:26.248096 systemd[1]: Starting ignition-files.service - Ignition (files)... May 27 17:00:26.294608 systemd[1]: Mounting sysroot-oem.mount - /sysroot/oem... May 27 17:00:26.342995 kernel: BTRFS: device label OEM devid 1 transid 15 /dev/nvme0n1p6 (259:3) scanned by mount (1322) May 27 17:00:26.347324 kernel: BTRFS info (device nvme0n1p6): first mount of filesystem 0631e8fb-ef71-4ba1-b2b8-88386996a754 May 27 17:00:26.347388 kernel: BTRFS info (device nvme0n1p6): using crc32c (crc32c-generic) checksum algorithm May 27 17:00:26.348580 kernel: BTRFS info (device nvme0n1p6): using free-space-tree May 27 17:00:26.358369 systemd[1]: Mounted sysroot-oem.mount - /sysroot/oem. May 27 17:00:26.402966 ignition[1339]: INFO : Ignition 2.21.0 May 27 17:00:26.402966 ignition[1339]: INFO : Stage: files May 27 17:00:26.406444 ignition[1339]: INFO : no configs at "/usr/lib/ignition/base.d" May 27 17:00:26.406444 ignition[1339]: INFO : no config dir at "/usr/lib/ignition/base.platform.d/aws" May 27 17:00:26.406444 ignition[1339]: INFO : PUT http://169.254.169.254/latest/api/token: attempt #1 May 27 17:00:26.414735 ignition[1339]: INFO : PUT result: OK May 27 17:00:26.419155 ignition[1339]: DEBUG : files: compiled without relabeling support, skipping May 27 17:00:26.422601 ignition[1339]: INFO : files: ensureUsers: op(1): [started] creating or modifying user "core" May 27 17:00:26.425330 ignition[1339]: DEBUG : files: ensureUsers: op(1): executing: "usermod" "--root" "/sysroot" "core" May 27 17:00:26.431986 ignition[1339]: INFO : files: ensureUsers: op(1): [finished] creating or modifying user "core" May 27 17:00:26.434738 ignition[1339]: INFO : files: ensureUsers: op(2): [started] adding ssh keys to user "core" May 27 17:00:26.434738 ignition[1339]: INFO : files: ensureUsers: op(2): [finished] adding ssh keys to user "core" May 27 17:00:26.433739 unknown[1339]: wrote ssh authorized keys file for user: core May 27 17:00:26.446293 ignition[1339]: INFO : files: createFilesystemsFiles: createFiles: op(3): [started] writing file "/sysroot/etc/flatcar/update.conf" May 27 17:00:26.449668 ignition[1339]: INFO : files: createFilesystemsFiles: createFiles: op(3): [finished] writing file "/sysroot/etc/flatcar/update.conf" May 27 17:00:26.449668 ignition[1339]: INFO : files: createResultFile: createFiles: op(4): [started] writing file "/sysroot/etc/.ignition-result.json" May 27 17:00:26.449668 ignition[1339]: INFO : files: createResultFile: createFiles: op(4): [finished] writing file "/sysroot/etc/.ignition-result.json" May 27 17:00:26.449668 ignition[1339]: INFO : files: files passed May 27 17:00:26.449668 ignition[1339]: INFO : Ignition finished successfully May 27 17:00:26.465021 systemd[1]: Finished ignition-files.service - Ignition (files). May 27 17:00:26.470047 systemd[1]: Starting ignition-quench.service - Ignition (record completion)... May 27 17:00:26.477302 systemd[1]: Starting initrd-setup-root-after-ignition.service - Root filesystem completion... May 27 17:00:26.504680 systemd[1]: ignition-quench.service: Deactivated successfully. May 27 17:00:26.507452 systemd[1]: Finished ignition-quench.service - Ignition (record completion). May 27 17:00:26.522770 initrd-setup-root-after-ignition[1368]: grep: /sysroot/etc/flatcar/enabled-sysext.conf: No such file or directory May 27 17:00:26.522770 initrd-setup-root-after-ignition[1368]: grep: /sysroot/usr/share/flatcar/enabled-sysext.conf: No such file or directory May 27 17:00:26.529778 initrd-setup-root-after-ignition[1372]: grep: /sysroot/etc/flatcar/enabled-sysext.conf: No such file or directory May 27 17:00:26.535556 systemd[1]: Finished initrd-setup-root-after-ignition.service - Root filesystem completion. May 27 17:00:26.539261 systemd[1]: Reached target ignition-complete.target - Ignition Complete. May 27 17:00:26.547614 systemd[1]: Starting initrd-parse-etc.service - Mountpoints Configured in the Real Root... May 27 17:00:26.619199 systemd[1]: initrd-parse-etc.service: Deactivated successfully. May 27 17:00:26.621090 systemd[1]: Finished initrd-parse-etc.service - Mountpoints Configured in the Real Root. May 27 17:00:26.624208 systemd[1]: Reached target initrd-fs.target - Initrd File Systems. May 27 17:00:26.626325 systemd[1]: Reached target initrd.target - Initrd Default Target. May 27 17:00:26.630596 systemd[1]: dracut-mount.service - dracut mount hook was skipped because no trigger condition checks were met. May 27 17:00:26.632035 systemd[1]: Starting dracut-pre-pivot.service - dracut pre-pivot and cleanup hook... May 27 17:00:26.689542 systemd[1]: Finished dracut-pre-pivot.service - dracut pre-pivot and cleanup hook. May 27 17:00:26.695690 systemd[1]: Starting initrd-cleanup.service - Cleaning Up and Shutting Down Daemons... May 27 17:00:26.740806 systemd[1]: Stopped target nss-lookup.target - Host and Network Name Lookups. May 27 17:00:26.745294 systemd[1]: Stopped target remote-cryptsetup.target - Remote Encrypted Volumes. May 27 17:00:26.747864 systemd[1]: Stopped target timers.target - Timer Units. May 27 17:00:26.750759 systemd[1]: dracut-pre-pivot.service: Deactivated successfully. May 27 17:00:26.751105 systemd[1]: Stopped dracut-pre-pivot.service - dracut pre-pivot and cleanup hook. May 27 17:00:26.770626 systemd[1]: Stopped target initrd.target - Initrd Default Target. May 27 17:00:26.774919 systemd[1]: Stopped target basic.target - Basic System. May 27 17:00:26.781169 systemd[1]: Stopped target ignition-complete.target - Ignition Complete. May 27 17:00:26.783612 systemd[1]: Stopped target ignition-diskful.target - Ignition Boot Disk Setup. May 27 17:00:26.790348 systemd[1]: Stopped target initrd-root-device.target - Initrd Root Device. May 27 17:00:26.795183 systemd[1]: Stopped target initrd-usr-fs.target - Initrd /usr File System. May 27 17:00:26.799665 systemd[1]: Stopped target remote-fs.target - Remote File Systems. May 27 17:00:26.802304 systemd[1]: Stopped target remote-fs-pre.target - Preparation for Remote File Systems. May 27 17:00:26.809543 systemd[1]: Stopped target sysinit.target - System Initialization. May 27 17:00:26.812166 systemd[1]: Stopped target local-fs.target - Local File Systems. May 27 17:00:26.818690 systemd[1]: Stopped target swap.target - Swaps. May 27 17:00:26.820538 systemd[1]: dracut-pre-mount.service: Deactivated successfully. May 27 17:00:26.820798 systemd[1]: Stopped dracut-pre-mount.service - dracut pre-mount hook. May 27 17:00:26.828856 systemd[1]: Stopped target cryptsetup.target - Local Encrypted Volumes. May 27 17:00:26.831567 systemd[1]: Stopped target cryptsetup-pre.target - Local Encrypted Volumes (Pre). May 27 17:00:26.838358 systemd[1]: clevis-luks-askpass.path: Deactivated successfully. May 27 17:00:26.840435 systemd[1]: Stopped clevis-luks-askpass.path - Forward Password Requests to Clevis Directory Watch. May 27 17:00:26.843157 systemd[1]: dracut-initqueue.service: Deactivated successfully. May 27 17:00:26.843399 systemd[1]: Stopped dracut-initqueue.service - dracut initqueue hook. May 27 17:00:26.851086 systemd[1]: initrd-setup-root-after-ignition.service: Deactivated successfully. May 27 17:00:26.851523 systemd[1]: Stopped initrd-setup-root-after-ignition.service - Root filesystem completion. May 27 17:00:26.858683 systemd[1]: ignition-files.service: Deactivated successfully. May 27 17:00:26.859124 systemd[1]: Stopped ignition-files.service - Ignition (files). May 27 17:00:26.866246 systemd[1]: Stopping ignition-mount.service - Ignition (mount)... May 27 17:00:26.873185 systemd[1]: Stopping sysroot-boot.service - /sysroot/boot... May 27 17:00:26.877792 systemd[1]: systemd-udev-trigger.service: Deactivated successfully. May 27 17:00:26.878161 systemd[1]: Stopped systemd-udev-trigger.service - Coldplug All udev Devices. May 27 17:00:26.885060 systemd[1]: dracut-pre-trigger.service: Deactivated successfully. May 27 17:00:26.890142 systemd[1]: Stopped dracut-pre-trigger.service - dracut pre-trigger hook. May 27 17:00:26.905129 systemd[1]: initrd-cleanup.service: Deactivated successfully. May 27 17:00:26.905373 systemd[1]: Finished initrd-cleanup.service - Cleaning Up and Shutting Down Daemons. May 27 17:00:26.940751 ignition[1392]: INFO : Ignition 2.21.0 May 27 17:00:26.942844 ignition[1392]: INFO : Stage: umount May 27 17:00:26.944698 ignition[1392]: INFO : no configs at "/usr/lib/ignition/base.d" May 27 17:00:26.944698 ignition[1392]: INFO : no config dir at "/usr/lib/ignition/base.platform.d/aws" May 27 17:00:26.950288 ignition[1392]: INFO : PUT http://169.254.169.254/latest/api/token: attempt #1 May 27 17:00:26.953153 ignition[1392]: INFO : PUT result: OK May 27 17:00:26.958249 ignition[1392]: INFO : umount: umount passed May 27 17:00:26.960129 ignition[1392]: INFO : Ignition finished successfully May 27 17:00:26.966240 systemd[1]: sysroot-boot.mount: Deactivated successfully. May 27 17:00:26.970535 systemd[1]: ignition-mount.service: Deactivated successfully. May 27 17:00:26.970771 systemd[1]: Stopped ignition-mount.service - Ignition (mount). May 27 17:00:26.978573 systemd[1]: ignition-disks.service: Deactivated successfully. May 27 17:00:26.979429 systemd[1]: Stopped ignition-disks.service - Ignition (disks). May 27 17:00:26.986085 systemd[1]: ignition-kargs.service: Deactivated successfully. May 27 17:00:26.986232 systemd[1]: Stopped ignition-kargs.service - Ignition (kargs). May 27 17:00:26.991473 systemd[1]: ignition-fetch.service: Deactivated successfully. May 27 17:00:26.991583 systemd[1]: Stopped ignition-fetch.service - Ignition (fetch). May 27 17:00:26.997694 systemd[1]: Stopped target network.target - Network. May 27 17:00:27.000878 systemd[1]: ignition-fetch-offline.service: Deactivated successfully. May 27 17:00:27.001069 systemd[1]: Stopped ignition-fetch-offline.service - Ignition (fetch-offline). May 27 17:00:27.004404 systemd[1]: Stopped target paths.target - Path Units. May 27 17:00:27.010021 systemd[1]: systemd-ask-password-console.path: Deactivated successfully. May 27 17:00:27.013152 systemd[1]: Stopped systemd-ask-password-console.path - Dispatch Password Requests to Console Directory Watch. May 27 17:00:27.015608 systemd[1]: Stopped target slices.target - Slice Units. May 27 17:00:27.015762 systemd[1]: Stopped target sockets.target - Socket Units. May 27 17:00:27.016488 systemd[1]: iscsid.socket: Deactivated successfully. May 27 17:00:27.016567 systemd[1]: Closed iscsid.socket - Open-iSCSI iscsid Socket. May 27 17:00:27.016827 systemd[1]: iscsiuio.socket: Deactivated successfully. May 27 17:00:27.016894 systemd[1]: Closed iscsiuio.socket - Open-iSCSI iscsiuio Socket. May 27 17:00:27.019425 systemd[1]: ignition-setup.service: Deactivated successfully. May 27 17:00:27.019520 systemd[1]: Stopped ignition-setup.service - Ignition (setup). May 27 17:00:27.019787 systemd[1]: ignition-setup-pre.service: Deactivated successfully. May 27 17:00:27.019871 systemd[1]: Stopped ignition-setup-pre.service - Ignition env setup. May 27 17:00:27.020635 systemd[1]: Stopping systemd-networkd.service - Network Configuration... May 27 17:00:27.020823 systemd[1]: Stopping systemd-resolved.service - Network Name Resolution... May 27 17:00:27.023922 systemd[1]: sysroot-boot.service: Deactivated successfully. May 27 17:00:27.024432 systemd[1]: Stopped sysroot-boot.service - /sysroot/boot. May 27 17:00:27.053259 systemd[1]: initrd-setup-root.service: Deactivated successfully. May 27 17:00:27.053435 systemd[1]: Stopped initrd-setup-root.service - Root filesystem setup. May 27 17:00:27.073173 systemd-networkd[1147]: eth0: Gained IPv6LL May 27 17:00:27.076626 systemd[1]: systemd-resolved.service: Deactivated successfully. May 27 17:00:27.077586 systemd[1]: Stopped systemd-resolved.service - Network Name Resolution. May 27 17:00:27.087522 systemd[1]: run-credentials-systemd\x2dresolved.service.mount: Deactivated successfully. May 27 17:00:27.088860 systemd[1]: systemd-networkd.service: Deactivated successfully. May 27 17:00:27.089820 systemd[1]: Stopped systemd-networkd.service - Network Configuration. May 27 17:00:27.110050 systemd[1]: run-credentials-systemd\x2dnetworkd.service.mount: Deactivated successfully. May 27 17:00:27.113164 systemd[1]: Stopped target network-pre.target - Preparation for Network. May 27 17:00:27.117635 systemd[1]: systemd-networkd.socket: Deactivated successfully. May 27 17:00:27.117708 systemd[1]: Closed systemd-networkd.socket - Network Service Netlink Socket. May 27 17:00:27.124159 systemd[1]: Stopping network-cleanup.service - Network Cleanup... May 27 17:00:27.126051 systemd[1]: parse-ip-for-networkd.service: Deactivated successfully. May 27 17:00:27.126167 systemd[1]: Stopped parse-ip-for-networkd.service - Write systemd-networkd units from cmdline. May 27 17:00:27.129378 systemd[1]: systemd-sysctl.service: Deactivated successfully. May 27 17:00:27.129493 systemd[1]: Stopped systemd-sysctl.service - Apply Kernel Variables. May 27 17:00:27.145172 systemd[1]: systemd-modules-load.service: Deactivated successfully. May 27 17:00:27.145283 systemd[1]: Stopped systemd-modules-load.service - Load Kernel Modules. May 27 17:00:27.151606 systemd[1]: systemd-tmpfiles-setup.service: Deactivated successfully. May 27 17:00:27.151724 systemd[1]: Stopped systemd-tmpfiles-setup.service - Create System Files and Directories. May 27 17:00:27.158870 systemd[1]: Stopping systemd-udevd.service - Rule-based Manager for Device Events and Files... May 27 17:00:27.165824 systemd[1]: run-credentials-systemd\x2dsysctl.service.mount: Deactivated successfully. May 27 17:00:27.168904 systemd[1]: run-credentials-systemd\x2dtmpfiles\x2dsetup.service.mount: Deactivated successfully. May 27 17:00:27.201640 systemd[1]: systemd-udevd.service: Deactivated successfully. May 27 17:00:27.202797 systemd[1]: Stopped systemd-udevd.service - Rule-based Manager for Device Events and Files. May 27 17:00:27.211907 systemd[1]: systemd-udevd-control.socket: Deactivated successfully. May 27 17:00:27.213248 systemd[1]: Closed systemd-udevd-control.socket - udev Control Socket. May 27 17:00:27.219363 systemd[1]: systemd-udevd-kernel.socket: Deactivated successfully. May 27 17:00:27.219454 systemd[1]: Closed systemd-udevd-kernel.socket - udev Kernel Socket. May 27 17:00:27.222068 systemd[1]: dracut-pre-udev.service: Deactivated successfully. May 27 17:00:27.222173 systemd[1]: Stopped dracut-pre-udev.service - dracut pre-udev hook. May 27 17:00:27.226141 systemd[1]: dracut-cmdline.service: Deactivated successfully. May 27 17:00:27.226229 systemd[1]: Stopped dracut-cmdline.service - dracut cmdline hook. May 27 17:00:27.236229 systemd[1]: dracut-cmdline-ask.service: Deactivated successfully. May 27 17:00:27.237250 systemd[1]: Stopped dracut-cmdline-ask.service - dracut ask for additional cmdline parameters. May 27 17:00:27.246613 systemd[1]: Starting initrd-udevadm-cleanup-db.service - Cleanup udev Database... May 27 17:00:27.249136 systemd[1]: systemd-network-generator.service: Deactivated successfully. May 27 17:00:27.249263 systemd[1]: Stopped systemd-network-generator.service - Generate network units from Kernel command line. May 27 17:00:27.260327 systemd[1]: systemd-tmpfiles-setup-dev.service: Deactivated successfully. May 27 17:00:27.261197 systemd[1]: Stopped systemd-tmpfiles-setup-dev.service - Create Static Device Nodes in /dev. May 27 17:00:27.268606 systemd[1]: systemd-tmpfiles-setup-dev-early.service: Deactivated successfully. May 27 17:00:27.268831 systemd[1]: Stopped systemd-tmpfiles-setup-dev-early.service - Create Static Device Nodes in /dev gracefully. May 27 17:00:27.282629 systemd[1]: kmod-static-nodes.service: Deactivated successfully. May 27 17:00:27.282733 systemd[1]: Stopped kmod-static-nodes.service - Create List of Static Device Nodes. May 27 17:00:27.285592 systemd[1]: systemd-vconsole-setup.service: Deactivated successfully. May 27 17:00:27.285681 systemd[1]: Stopped systemd-vconsole-setup.service - Virtual Console Setup. May 27 17:00:27.308710 systemd[1]: network-cleanup.service: Deactivated successfully. May 27 17:00:27.311254 systemd[1]: Stopped network-cleanup.service - Network Cleanup. May 27 17:00:27.316070 systemd[1]: initrd-udevadm-cleanup-db.service: Deactivated successfully. May 27 17:00:27.316243 systemd[1]: Finished initrd-udevadm-cleanup-db.service - Cleanup udev Database. May 27 17:00:27.320313 systemd[1]: Reached target initrd-switch-root.target - Switch Root. May 27 17:00:27.329040 systemd[1]: Starting initrd-switch-root.service - Switch Root... May 27 17:00:27.359601 systemd[1]: Switching root. May 27 17:00:27.413733 systemd-journald[257]: Journal stopped May 27 17:00:29.572806 systemd-journald[257]: Received SIGTERM from PID 1 (systemd). May 27 17:00:29.574104 kernel: SELinux: policy capability network_peer_controls=1 May 27 17:00:29.574180 kernel: SELinux: policy capability open_perms=1 May 27 17:00:29.574219 kernel: SELinux: policy capability extended_socket_class=1 May 27 17:00:29.574251 kernel: SELinux: policy capability always_check_network=0 May 27 17:00:29.574281 kernel: SELinux: policy capability cgroup_seclabel=1 May 27 17:00:29.574311 kernel: SELinux: policy capability nnp_nosuid_transition=1 May 27 17:00:29.574342 kernel: SELinux: policy capability genfs_seclabel_symlinks=0 May 27 17:00:29.574368 kernel: SELinux: policy capability ioctl_skip_cloexec=0 May 27 17:00:29.574396 kernel: SELinux: policy capability userspace_initial_context=0 May 27 17:00:29.574450 kernel: audit: type=1403 audit(1748365227.565:2): auid=4294967295 ses=4294967295 lsm=selinux res=1 May 27 17:00:29.574501 systemd[1]: Successfully loaded SELinux policy in 62.369ms. May 27 17:00:29.574546 systemd[1]: Relabeled /dev/, /dev/shm/, /run/ in 24.407ms. May 27 17:00:29.574579 systemd[1]: systemd 256.8 running in system mode (+PAM +AUDIT +SELINUX -APPARMOR +IMA +SMACK +SECCOMP -GCRYPT -GNUTLS +OPENSSL -ACL +BLKID +CURL +ELFUTILS -FIDO2 +IDN2 -IDN +IPTC +KMOD +LIBCRYPTSETUP +LIBCRYPTSETUP_PLUGINS +LIBFDISK +PCRE2 -PWQUALITY -P11KIT -QRENCODE +TPM2 +BZIP2 +LZ4 +XZ +ZLIB +ZSTD -BPF_FRAMEWORK -XKBCOMMON +UTMP -SYSVINIT +LIBARCHIVE) May 27 17:00:29.574609 systemd[1]: Detected virtualization amazon. May 27 17:00:29.574640 systemd[1]: Detected architecture arm64. May 27 17:00:29.574670 systemd[1]: Detected first boot. May 27 17:00:29.574710 systemd[1]: Initializing machine ID from VM UUID. May 27 17:00:29.574748 zram_generator::config[1435]: No configuration found. May 27 17:00:29.574781 kernel: NET: Registered PF_VSOCK protocol family May 27 17:00:29.574810 systemd[1]: Populated /etc with preset unit settings. May 27 17:00:29.574841 systemd[1]: run-credentials-systemd\x2djournald.service.mount: Deactivated successfully. May 27 17:00:29.574872 systemd[1]: initrd-switch-root.service: Deactivated successfully. May 27 17:00:29.574904 systemd[1]: Stopped initrd-switch-root.service - Switch Root. May 27 17:00:29.581078 systemd[1]: systemd-journald.service: Scheduled restart job, restart counter is at 1. May 27 17:00:29.581174 systemd[1]: Created slice system-addon\x2dconfig.slice - Slice /system/addon-config. May 27 17:00:29.581209 systemd[1]: Created slice system-addon\x2drun.slice - Slice /system/addon-run. May 27 17:00:29.581239 systemd[1]: Created slice system-getty.slice - Slice /system/getty. May 27 17:00:29.581270 systemd[1]: Created slice system-modprobe.slice - Slice /system/modprobe. May 27 17:00:29.581303 systemd[1]: Created slice system-serial\x2dgetty.slice - Slice /system/serial-getty. May 27 17:00:29.581337 systemd[1]: Created slice system-system\x2dcloudinit.slice - Slice /system/system-cloudinit. May 27 17:00:29.581367 systemd[1]: Created slice system-systemd\x2dfsck.slice - Slice /system/systemd-fsck. May 27 17:00:29.581395 systemd[1]: Created slice user.slice - User and Session Slice. May 27 17:00:29.581432 systemd[1]: Started clevis-luks-askpass.path - Forward Password Requests to Clevis Directory Watch. May 27 17:00:29.581478 systemd[1]: Started systemd-ask-password-console.path - Dispatch Password Requests to Console Directory Watch. May 27 17:00:29.581527 systemd[1]: Started systemd-ask-password-wall.path - Forward Password Requests to Wall Directory Watch. May 27 17:00:29.581561 systemd[1]: Set up automount boot.automount - Boot partition Automount Point. May 27 17:00:29.581590 systemd[1]: Set up automount proc-sys-fs-binfmt_misc.automount - Arbitrary Executable File Formats File System Automount Point. May 27 17:00:29.581622 systemd[1]: Expecting device dev-disk-by\x2dlabel-OEM.device - /dev/disk/by-label/OEM... May 27 17:00:29.581654 systemd[1]: Expecting device dev-ttyS0.device - /dev/ttyS0... May 27 17:00:29.581683 systemd[1]: Reached target cryptsetup-pre.target - Local Encrypted Volumes (Pre). May 27 17:00:29.581717 systemd[1]: Reached target cryptsetup.target - Local Encrypted Volumes. May 27 17:00:29.581746 systemd[1]: Stopped target initrd-switch-root.target - Switch Root. May 27 17:00:29.581775 systemd[1]: Stopped target initrd-fs.target - Initrd File Systems. May 27 17:00:29.581803 systemd[1]: Stopped target initrd-root-fs.target - Initrd Root File System. May 27 17:00:29.581832 systemd[1]: Reached target integritysetup.target - Local Integrity Protected Volumes. May 27 17:00:29.581859 systemd[1]: Reached target remote-cryptsetup.target - Remote Encrypted Volumes. May 27 17:00:29.581890 systemd[1]: Reached target remote-fs.target - Remote File Systems. May 27 17:00:29.581922 systemd[1]: Reached target slices.target - Slice Units. May 27 17:00:29.582900 systemd[1]: Reached target swap.target - Swaps. May 27 17:00:29.582976 systemd[1]: Reached target veritysetup.target - Local Verity Protected Volumes. May 27 17:00:29.583021 systemd[1]: Listening on systemd-coredump.socket - Process Core Dump Socket. May 27 17:00:29.583055 systemd[1]: Listening on systemd-creds.socket - Credential Encryption/Decryption. May 27 17:00:29.583088 systemd[1]: Listening on systemd-networkd.socket - Network Service Netlink Socket. May 27 17:00:29.583119 systemd[1]: Listening on systemd-udevd-control.socket - udev Control Socket. May 27 17:00:29.583150 systemd[1]: Listening on systemd-udevd-kernel.socket - udev Kernel Socket. May 27 17:00:29.583178 systemd[1]: Listening on systemd-userdbd.socket - User Database Manager Socket. May 27 17:00:29.583208 systemd[1]: Mounting dev-hugepages.mount - Huge Pages File System... May 27 17:00:29.589993 systemd[1]: Mounting dev-mqueue.mount - POSIX Message Queue File System... May 27 17:00:29.590067 systemd[1]: Mounting media.mount - External Media Directory... May 27 17:00:29.590111 systemd[1]: Mounting sys-kernel-debug.mount - Kernel Debug File System... May 27 17:00:29.590142 systemd[1]: Mounting sys-kernel-tracing.mount - Kernel Trace File System... May 27 17:00:29.590173 systemd[1]: Mounting tmp.mount - Temporary Directory /tmp... May 27 17:00:29.590203 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). May 27 17:00:29.590243 systemd[1]: Reached target machines.target - Containers. May 27 17:00:29.590273 systemd[1]: Starting flatcar-tmpfiles.service - Create missing system files... May 27 17:00:29.590306 systemd[1]: ignition-delete-config.service - Ignition (delete config) was skipped because no trigger condition checks were met. May 27 17:00:29.590335 systemd[1]: Starting kmod-static-nodes.service - Create List of Static Device Nodes... May 27 17:00:29.590369 systemd[1]: Starting modprobe@configfs.service - Load Kernel Module configfs... May 27 17:00:29.590398 systemd[1]: Starting modprobe@dm_mod.service - Load Kernel Module dm_mod... May 27 17:00:29.590455 systemd[1]: Starting modprobe@drm.service - Load Kernel Module drm... May 27 17:00:29.590487 systemd[1]: Starting modprobe@efi_pstore.service - Load Kernel Module efi_pstore... May 27 17:00:29.590518 systemd[1]: Starting modprobe@fuse.service - Load Kernel Module fuse... May 27 17:00:29.590547 systemd[1]: Starting modprobe@loop.service - Load Kernel Module loop... May 27 17:00:29.590576 systemd[1]: setup-nsswitch.service - Create /etc/nsswitch.conf was skipped because of an unmet condition check (ConditionPathExists=!/etc/nsswitch.conf). May 27 17:00:29.590604 systemd[1]: systemd-fsck-root.service: Deactivated successfully. May 27 17:00:29.590643 systemd[1]: Stopped systemd-fsck-root.service - File System Check on Root Device. May 27 17:00:29.590675 systemd[1]: systemd-fsck-usr.service: Deactivated successfully. May 27 17:00:29.590709 systemd[1]: Stopped systemd-fsck-usr.service. May 27 17:00:29.590739 systemd[1]: systemd-hibernate-clear.service - Clear Stale Hibernate Storage Info was skipped because of an unmet condition check (ConditionPathExists=/sys/firmware/efi/efivars/HibernateLocation-8cf2644b-4b0b-428f-9387-6d876050dc67). May 27 17:00:29.590767 systemd[1]: Starting systemd-journald.service - Journal Service... May 27 17:00:29.590795 systemd[1]: Starting systemd-modules-load.service - Load Kernel Modules... May 27 17:00:29.590824 systemd[1]: Starting systemd-network-generator.service - Generate network units from Kernel command line... May 27 17:00:29.590855 systemd[1]: Starting systemd-remount-fs.service - Remount Root and Kernel File Systems... May 27 17:00:29.590883 systemd[1]: Starting systemd-udev-load-credentials.service - Load udev Rules from Credentials... May 27 17:00:29.590916 systemd[1]: Starting systemd-udev-trigger.service - Coldplug All udev Devices... May 27 17:00:29.597588 systemd[1]: verity-setup.service: Deactivated successfully. May 27 17:00:29.597655 systemd[1]: Stopped verity-setup.service. May 27 17:00:29.597685 systemd[1]: Mounted dev-hugepages.mount - Huge Pages File System. May 27 17:00:29.597715 systemd[1]: Mounted dev-mqueue.mount - POSIX Message Queue File System. May 27 17:00:29.597756 systemd[1]: Mounted media.mount - External Media Directory. May 27 17:00:29.597792 systemd[1]: Mounted sys-kernel-debug.mount - Kernel Debug File System. May 27 17:00:29.597821 systemd[1]: Mounted sys-kernel-tracing.mount - Kernel Trace File System. May 27 17:00:29.597849 systemd[1]: Mounted tmp.mount - Temporary Directory /tmp. May 27 17:00:29.597877 systemd[1]: Finished kmod-static-nodes.service - Create List of Static Device Nodes. May 27 17:00:29.598034 systemd[1]: modprobe@configfs.service: Deactivated successfully. May 27 17:00:29.598072 systemd[1]: Finished modprobe@configfs.service - Load Kernel Module configfs. May 27 17:00:29.598102 systemd[1]: modprobe@dm_mod.service: Deactivated successfully. May 27 17:00:29.598135 systemd[1]: Finished modprobe@dm_mod.service - Load Kernel Module dm_mod. May 27 17:00:29.598164 systemd[1]: modprobe@efi_pstore.service: Deactivated successfully. May 27 17:00:29.598192 systemd[1]: Finished modprobe@efi_pstore.service - Load Kernel Module efi_pstore. May 27 17:00:29.598220 systemd[1]: Finished systemd-modules-load.service - Load Kernel Modules. May 27 17:00:29.598249 systemd[1]: Mounting sys-kernel-config.mount - Kernel Configuration File System... May 27 17:00:29.598278 systemd[1]: Starting systemd-sysctl.service - Apply Kernel Variables... May 27 17:00:29.598314 systemd[1]: Starting systemd-tmpfiles-setup-dev-early.service - Create Static Device Nodes in /dev gracefully... May 27 17:00:29.598343 systemd[1]: Finished systemd-remount-fs.service - Remount Root and Kernel File Systems. May 27 17:00:29.598373 systemd[1]: Mounted sys-kernel-config.mount - Kernel Configuration File System. May 27 17:00:29.598420 systemd[1]: remount-root.service - Remount Root File System was skipped because of an unmet condition check (ConditionPathIsReadWrite=!/). May 27 17:00:29.598456 systemd[1]: Reached target local-fs.target - Local File Systems. May 27 17:00:29.598485 systemd[1]: Listening on systemd-sysext.socket - System Extension Image Management. May 27 17:00:29.598516 systemd[1]: Starting ldconfig.service - Rebuild Dynamic Linker Cache... May 27 17:00:29.598543 kernel: fuse: init (API version 7.41) May 27 17:00:29.598570 systemd[1]: systemd-binfmt.service - Set Up Additional Binary Formats was skipped because no trigger condition checks were met. May 27 17:00:29.598604 systemd[1]: Starting systemd-hwdb-update.service - Rebuild Hardware Database... May 27 17:00:29.598633 systemd[1]: systemd-pstore.service - Platform Persistent Storage Archival was skipped because of an unmet condition check (ConditionDirectoryNotEmpty=/sys/fs/pstore). May 27 17:00:29.598668 systemd[1]: Starting systemd-random-seed.service - Load/Save OS Random Seed... May 27 17:00:29.598698 systemd[1]: Starting systemd-sysext.service - Merge System Extension Images into /usr/ and /opt/... May 27 17:00:29.598726 kernel: loop: module loaded May 27 17:00:29.598757 systemd[1]: modprobe@fuse.service: Deactivated successfully. May 27 17:00:29.598795 systemd[1]: Finished modprobe@fuse.service - Load Kernel Module fuse. May 27 17:00:29.598824 systemd[1]: Mounting sys-fs-fuse-connections.mount - FUSE Control File System... May 27 17:00:29.598852 systemd[1]: modprobe@loop.service: Deactivated successfully. May 27 17:00:29.598880 systemd[1]: Finished modprobe@loop.service - Load Kernel Module loop. May 27 17:00:29.598908 systemd[1]: systemd-repart.service - Repartition Root Disk was skipped because no trigger condition checks were met. May 27 17:00:29.603414 systemd[1]: Finished flatcar-tmpfiles.service - Create missing system files. May 27 17:00:29.603494 kernel: ACPI: bus type drm_connector registered May 27 17:00:29.603539 systemd[1]: Finished systemd-sysctl.service - Apply Kernel Variables. May 27 17:00:29.603569 systemd[1]: modprobe@drm.service: Deactivated successfully. May 27 17:00:29.603598 systemd[1]: Finished modprobe@drm.service - Load Kernel Module drm. May 27 17:00:29.603630 systemd[1]: Finished systemd-network-generator.service - Generate network units from Kernel command line. May 27 17:00:29.603660 systemd[1]: Finished systemd-udev-load-credentials.service - Load udev Rules from Credentials. May 27 17:00:29.603691 kernel: loop0: detected capacity change from 0 to 138376 May 27 17:00:29.603722 systemd[1]: Mounted sys-fs-fuse-connections.mount - FUSE Control File System. May 27 17:00:29.603762 systemd[1]: Reached target network-pre.target - Preparation for Network. May 27 17:00:29.603791 systemd[1]: Finished systemd-random-seed.service - Load/Save OS Random Seed. May 27 17:00:29.603826 systemd[1]: Reached target first-boot-complete.target - First Boot Complete. May 27 17:00:29.603855 systemd[1]: Starting systemd-machine-id-commit.service - Save Transient machine-id to Disk... May 27 17:00:29.603927 systemd-journald[1518]: Collecting audit messages is disabled. May 27 17:00:29.608206 kernel: squashfs: version 4.0 (2009/01/31) Phillip Lougher May 27 17:00:29.608251 systemd-journald[1518]: Journal started May 27 17:00:29.608301 systemd-journald[1518]: Runtime Journal (/run/log/journal/ec2efc5f08f7323a9d4d518f12e3a5de) is 8M, max 75.3M, 67.3M free. May 27 17:00:28.622912 systemd[1]: Queued start job for default target multi-user.target. May 27 17:00:28.638313 systemd[1]: Unnecessary job was removed for dev-nvme0n1p6.device - /dev/nvme0n1p6. May 27 17:00:28.639127 systemd[1]: systemd-journald.service: Deactivated successfully. May 27 17:00:29.561731 systemd-tmpfiles[1542]: ACLs are not supported, ignoring. May 27 17:00:29.617120 systemd[1]: Started systemd-journald.service - Journal Service. May 27 17:00:29.561756 systemd-tmpfiles[1542]: ACLs are not supported, ignoring. May 27 17:00:29.619557 systemd[1]: Finished systemd-tmpfiles-setup-dev-early.service - Create Static Device Nodes in /dev gracefully. May 27 17:00:29.643730 systemd[1]: etc-machine\x2did.mount: Deactivated successfully. May 27 17:00:29.647326 systemd[1]: Finished systemd-machine-id-commit.service - Save Transient machine-id to Disk. May 27 17:00:29.659182 kernel: loop1: detected capacity change from 0 to 107312 May 27 17:00:29.687342 systemd[1]: Starting systemd-journal-flush.service - Flush Journal to Persistent Storage... May 27 17:00:29.697368 systemd[1]: Starting systemd-sysusers.service - Create System Users... May 27 17:00:29.740041 kernel: loop2: detected capacity change from 0 to 61240 May 27 17:00:29.757811 systemd-journald[1518]: Time spent on flushing to /var/log/journal/ec2efc5f08f7323a9d4d518f12e3a5de is 92.537ms for 916 entries. May 27 17:00:29.757811 systemd-journald[1518]: System Journal (/var/log/journal/ec2efc5f08f7323a9d4d518f12e3a5de) is 8M, max 195.6M, 187.6M free. May 27 17:00:29.871738 systemd-journald[1518]: Received client request to flush runtime journal. May 27 17:00:29.871810 kernel: loop3: detected capacity change from 0 to 138376 May 27 17:00:29.871858 kernel: loop4: detected capacity change from 0 to 107312 May 27 17:00:29.773003 systemd[1]: Finished systemd-udev-trigger.service - Coldplug All udev Devices. May 27 17:00:29.859421 systemd[1]: Finished systemd-sysusers.service - Create System Users. May 27 17:00:29.876781 systemd[1]: Starting systemd-tmpfiles-setup-dev.service - Create Static Device Nodes in /dev... May 27 17:00:29.887072 systemd[1]: Finished systemd-journal-flush.service - Flush Journal to Persistent Storage. May 27 17:00:29.903002 kernel: loop5: detected capacity change from 0 to 61240 May 27 17:00:29.920302 (sd-merge)[1589]: Using extensions 'containerd-flatcar', 'docker-flatcar', 'oem-ami'. May 27 17:00:29.924331 (sd-merge)[1589]: Merged extensions into '/usr'. May 27 17:00:29.937397 systemd[1]: Finished systemd-sysext.service - Merge System Extension Images into /usr/ and /opt/. May 27 17:00:29.947116 systemd[1]: Starting ensure-sysext.service... May 27 17:00:29.956057 systemd[1]: Starting systemd-tmpfiles-setup.service - Create System Files and Directories... May 27 17:00:29.983249 systemd-tmpfiles[1592]: ACLs are not supported, ignoring. May 27 17:00:29.983281 systemd-tmpfiles[1592]: ACLs are not supported, ignoring. May 27 17:00:30.008528 systemd[1]: Reload requested from client PID 1596 ('systemctl') (unit ensure-sysext.service)... May 27 17:00:30.008552 systemd[1]: Reloading... May 27 17:00:30.066248 systemd-tmpfiles[1597]: /usr/lib/tmpfiles.d/nfs-utils.conf:6: Duplicate line for path "/var/lib/nfs/sm", ignoring. May 27 17:00:30.066830 systemd-tmpfiles[1597]: /usr/lib/tmpfiles.d/nfs-utils.conf:7: Duplicate line for path "/var/lib/nfs/sm.bak", ignoring. May 27 17:00:30.068103 systemd-tmpfiles[1597]: /usr/lib/tmpfiles.d/provision.conf:20: Duplicate line for path "/root", ignoring. May 27 17:00:30.068652 systemd-tmpfiles[1597]: /usr/lib/tmpfiles.d/systemd-flatcar.conf:6: Duplicate line for path "/var/log/journal", ignoring. May 27 17:00:30.071669 systemd-tmpfiles[1597]: /usr/lib/tmpfiles.d/systemd.conf:29: Duplicate line for path "/var/lib/systemd", ignoring. May 27 17:00:30.072437 systemd-tmpfiles[1597]: ACLs are not supported, ignoring. May 27 17:00:30.072706 systemd-tmpfiles[1597]: ACLs are not supported, ignoring. May 27 17:00:30.084869 systemd-tmpfiles[1597]: Detected autofs mount point /boot during canonicalization of boot. May 27 17:00:30.085108 systemd-tmpfiles[1597]: Skipping /boot May 27 17:00:30.147473 systemd-tmpfiles[1597]: Detected autofs mount point /boot during canonicalization of boot. May 27 17:00:30.147496 systemd-tmpfiles[1597]: Skipping /boot May 27 17:00:30.274007 zram_generator::config[1628]: No configuration found. May 27 17:00:30.527920 ldconfig[1544]: /sbin/ldconfig: /usr/lib/ld.so.conf is not an ELF file - it has the wrong magic bytes at the start. May 27 17:00:30.547287 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. May 27 17:00:30.736683 systemd[1]: Reloading finished in 726 ms. May 27 17:00:30.757031 systemd[1]: Finished ldconfig.service - Rebuild Dynamic Linker Cache. May 27 17:00:30.760379 systemd[1]: Finished systemd-tmpfiles-setup-dev.service - Create Static Device Nodes in /dev. May 27 17:00:30.790753 systemd[1]: Finished systemd-tmpfiles-setup.service - Create System Files and Directories. May 27 17:00:30.812427 systemd[1]: Starting audit-rules.service - Load Audit Rules... May 27 17:00:30.819333 systemd[1]: Starting clean-ca-certificates.service - Clean up broken links in /etc/ssl/certs... May 27 17:00:30.826352 systemd[1]: Starting systemd-journal-catalog-update.service - Rebuild Journal Catalog... May 27 17:00:30.837332 systemd[1]: Starting systemd-resolved.service - Network Name Resolution... May 27 17:00:30.846631 systemd[1]: Starting systemd-update-utmp.service - Record System Boot/Shutdown in UTMP... May 27 17:00:30.862183 systemd[1]: ignition-delete-config.service - Ignition (delete config) was skipped because no trigger condition checks were met. May 27 17:00:30.867180 systemd[1]: Starting modprobe@dm_mod.service - Load Kernel Module dm_mod... May 27 17:00:30.877219 systemd[1]: Starting modprobe@efi_pstore.service - Load Kernel Module efi_pstore... May 27 17:00:30.891484 systemd[1]: Starting modprobe@loop.service - Load Kernel Module loop... May 27 17:00:30.893750 systemd[1]: systemd-binfmt.service - Set Up Additional Binary Formats was skipped because no trigger condition checks were met. May 27 17:00:30.894044 systemd[1]: systemd-hibernate-clear.service - Clear Stale Hibernate Storage Info was skipped because of an unmet condition check (ConditionPathExists=/sys/firmware/efi/efivars/HibernateLocation-8cf2644b-4b0b-428f-9387-6d876050dc67). May 27 17:00:30.909332 systemd[1]: ignition-delete-config.service - Ignition (delete config) was skipped because no trigger condition checks were met. May 27 17:00:30.909845 systemd[1]: systemd-binfmt.service - Set Up Additional Binary Formats was skipped because no trigger condition checks were met. May 27 17:00:30.911337 systemd[1]: systemd-hibernate-clear.service - Clear Stale Hibernate Storage Info was skipped because of an unmet condition check (ConditionPathExists=/sys/firmware/efi/efivars/HibernateLocation-8cf2644b-4b0b-428f-9387-6d876050dc67). May 27 17:00:30.915436 systemd[1]: Finished systemd-update-utmp.service - Record System Boot/Shutdown in UTMP. May 27 17:00:30.936869 systemd[1]: Starting systemd-userdbd.service - User Database Manager... May 27 17:00:30.953327 systemd[1]: ignition-delete-config.service - Ignition (delete config) was skipped because no trigger condition checks were met. May 27 17:00:30.957299 systemd[1]: Starting modprobe@drm.service - Load Kernel Module drm... May 27 17:00:30.959581 systemd[1]: systemd-binfmt.service - Set Up Additional Binary Formats was skipped because no trigger condition checks were met. May 27 17:00:30.959837 systemd[1]: systemd-hibernate-clear.service - Clear Stale Hibernate Storage Info was skipped because of an unmet condition check (ConditionPathExists=/sys/firmware/efi/efivars/HibernateLocation-8cf2644b-4b0b-428f-9387-6d876050dc67). May 27 17:00:30.960226 systemd[1]: Reached target time-set.target - System Time Set. May 27 17:00:30.982332 systemd[1]: Finished ensure-sysext.service. May 27 17:00:31.023307 systemd[1]: modprobe@dm_mod.service: Deactivated successfully. May 27 17:00:31.023697 systemd[1]: Finished modprobe@dm_mod.service - Load Kernel Module dm_mod. May 27 17:00:31.054250 systemd[1]: Finished systemd-journal-catalog-update.service - Rebuild Journal Catalog. May 27 17:00:31.057464 systemd[1]: modprobe@efi_pstore.service: Deactivated successfully. May 27 17:00:31.057851 systemd[1]: Finished modprobe@efi_pstore.service - Load Kernel Module efi_pstore. May 27 17:00:31.062088 systemd[1]: modprobe@loop.service: Deactivated successfully. May 27 17:00:31.062514 systemd[1]: Finished modprobe@loop.service - Load Kernel Module loop. May 27 17:00:31.066902 systemd[1]: systemd-pstore.service - Platform Persistent Storage Archival was skipped because of an unmet condition check (ConditionDirectoryNotEmpty=/sys/fs/pstore). May 27 17:00:31.067121 systemd[1]: systemd-repart.service - Repartition Root Disk was skipped because no trigger condition checks were met. May 27 17:00:31.071724 systemd[1]: modprobe@drm.service: Deactivated successfully. May 27 17:00:31.072237 systemd[1]: Finished modprobe@drm.service - Load Kernel Module drm. May 27 17:00:31.080382 systemd[1]: Finished clean-ca-certificates.service - Clean up broken links in /etc/ssl/certs. May 27 17:00:31.084580 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). May 27 17:00:31.124254 systemd[1]: Finished systemd-hwdb-update.service - Rebuild Hardware Database. May 27 17:00:31.132322 systemd[1]: Starting systemd-udevd.service - Rule-based Manager for Device Events and Files... May 27 17:00:31.138308 systemd[1]: Starting systemd-update-done.service - Update is Completed... May 27 17:00:31.145038 augenrules[1721]: No rules May 27 17:00:31.147656 systemd[1]: audit-rules.service: Deactivated successfully. May 27 17:00:31.151382 systemd[1]: Finished audit-rules.service - Load Audit Rules. May 27 17:00:31.174122 systemd[1]: Started systemd-userdbd.service - User Database Manager. May 27 17:00:31.210050 systemd[1]: Finished systemd-update-done.service - Update is Completed. May 27 17:00:31.246925 systemd-udevd[1718]: Using default interface naming scheme 'v255'. May 27 17:00:31.302479 systemd[1]: Started systemd-udevd.service - Rule-based Manager for Device Events and Files. May 27 17:00:31.310446 systemd[1]: Starting systemd-networkd.service - Network Configuration... May 27 17:00:31.325884 systemd-resolved[1684]: Positive Trust Anchors: May 27 17:00:31.330049 systemd-resolved[1684]: . IN DS 20326 8 2 e06d44b80b8f1d39a95c0b0d7c65d08458e880409bbc683457104237c7f8ec8d May 27 17:00:31.330262 systemd-resolved[1684]: 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 May 27 17:00:31.354549 systemd-resolved[1684]: Defaulting to hostname 'linux'. May 27 17:00:31.363690 systemd[1]: Started systemd-resolved.service - Network Name Resolution. May 27 17:00:31.366272 systemd[1]: Reached target nss-lookup.target - Host and Network Name Lookups. May 27 17:00:31.369078 systemd[1]: Reached target sysinit.target - System Initialization. May 27 17:00:31.371340 systemd[1]: Started motdgen.path - Watch for update engine configuration changes. May 27 17:00:31.375204 systemd[1]: Started user-cloudinit@var-lib-flatcar\x2dinstall-user_data.path - Watch for a cloud-config at /var/lib/flatcar-install/user_data. May 27 17:00:31.377969 systemd[1]: Started logrotate.timer - Daily rotation of log files. May 27 17:00:31.381468 systemd[1]: Started mdadm.timer - Weekly check for MD array's redundancy information.. May 27 17:00:31.384673 systemd[1]: Started systemd-tmpfiles-clean.timer - Daily Cleanup of Temporary Directories. May 27 17:00:31.387373 systemd[1]: update-engine-stub.timer - Update Engine Stub Timer was skipped because of an unmet condition check (ConditionPathExists=/usr/.noupdate). May 27 17:00:31.387644 systemd[1]: Reached target paths.target - Path Units. May 27 17:00:31.391133 systemd[1]: Reached target timers.target - Timer Units. May 27 17:00:31.396649 systemd[1]: Listening on dbus.socket - D-Bus System Message Bus Socket. May 27 17:00:31.404808 systemd[1]: Starting docker.socket - Docker Socket for the API... May 27 17:00:31.417726 systemd[1]: Listening on sshd-unix-local.socket - OpenSSH Server Socket (systemd-ssh-generator, AF_UNIX Local). May 27 17:00:31.422315 systemd[1]: Listening on sshd-vsock.socket - OpenSSH Server Socket (systemd-ssh-generator, AF_VSOCK). May 27 17:00:31.425913 systemd[1]: Reached target ssh-access.target - SSH Access Available. May 27 17:00:31.478163 systemd[1]: Listening on sshd.socket - OpenSSH Server Socket. May 27 17:00:31.481905 systemd[1]: Listening on systemd-hostnamed.socket - Hostname Service Socket. May 27 17:00:31.492448 systemd[1]: Listening on docker.socket - Docker Socket for the API. May 27 17:00:31.504083 systemd[1]: Reached target sockets.target - Socket Units. May 27 17:00:31.506297 systemd[1]: Reached target basic.target - Basic System. May 27 17:00:31.509096 systemd[1]: addon-config@oem.service - Configure Addon /oem was skipped because no trigger condition checks were met. May 27 17:00:31.509167 systemd[1]: addon-run@oem.service - Run Addon /oem was skipped because no trigger condition checks were met. May 27 17:00:31.523764 systemd[1]: Starting coreos-metadata.service - Flatcar Metadata Agent... May 27 17:00:31.529890 systemd[1]: Starting dbus.service - D-Bus System Message Bus... May 27 17:00:31.537201 systemd[1]: Starting dracut-shutdown.service - Restore /run/initramfs on shutdown... May 27 17:00:31.550847 systemd[1]: Starting enable-oem-cloudinit.service - Enable cloudinit... May 27 17:00:31.564431 systemd[1]: Starting extend-filesystems.service - Extend Filesystems... May 27 17:00:31.566572 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). May 27 17:00:31.570487 systemd[1]: Starting motdgen.service - Generate /run/flatcar/motd... May 27 17:00:31.581393 systemd[1]: Started ntpd.service - Network Time Service. May 27 17:00:31.595396 systemd[1]: Starting setup-oem.service - Setup OEM... May 27 17:00:31.606487 systemd[1]: Starting ssh-key-proc-cmdline.service - Install an ssh key from /proc/cmdline... May 27 17:00:31.621489 systemd[1]: Starting sshd-keygen.service - Generate sshd host keys... May 27 17:00:31.644849 systemd[1]: Starting systemd-logind.service - User Login Management... May 27 17:00:31.650248 systemd[1]: tcsd.service - TCG Core Services Daemon was skipped because of an unmet condition check (ConditionPathExists=/dev/tpm0). May 27 17:00:31.664984 jq[1768]: false May 27 17:00:31.737049 (udev-worker)[1744]: Network interface NamePolicy= disabled on kernel command line. May 27 17:00:31.777352 systemd[1]: cgroup compatibility translation between legacy and unified hierarchy settings activated. See cgroup-compat debug messages for details. May 27 17:00:31.786450 systemd[1]: Starting update-engine.service - Update Engine... May 27 17:00:31.795853 systemd[1]: Starting update-ssh-keys-after-ignition.service - Run update-ssh-keys once after Ignition... May 27 17:00:31.802877 systemd[1]: Finished dracut-shutdown.service - Restore /run/initramfs on shutdown. May 27 17:00:31.806918 systemd[1]: enable-oem-cloudinit.service: Skipped due to 'exec-condition'. May 27 17:00:31.808250 systemd[1]: Condition check resulted in enable-oem-cloudinit.service - Enable cloudinit being skipped. May 27 17:00:31.809019 systemd[1]: motdgen.service: Deactivated successfully. May 27 17:00:31.809531 systemd[1]: Finished motdgen.service - Generate /run/flatcar/motd. May 27 17:00:31.879056 systemd[1]: ssh-key-proc-cmdline.service: Deactivated successfully. May 27 17:00:31.879548 systemd[1]: Finished ssh-key-proc-cmdline.service - Install an ssh key from /proc/cmdline. May 27 17:00:31.915395 jq[1787]: true May 27 17:00:31.924808 coreos-metadata[1764]: May 27 17:00:31.921 INFO Putting http://169.254.169.254/latest/api/token: Attempt #1 May 27 17:00:31.963263 update_engine[1786]: I20250527 17:00:31.960083 1786 main.cc:92] Flatcar Update Engine starting May 27 17:00:31.979401 systemd[1]: Started dbus.service - D-Bus System Message Bus. May 27 17:00:31.979066 dbus-daemon[1766]: [system] SELinux support is enabled May 27 17:00:31.987434 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). May 27 17:00:31.987515 systemd[1]: Reached target system-config.target - Load system-provided cloud configs. May 27 17:00:31.990141 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). May 27 17:00:31.990184 systemd[1]: Reached target user-config.target - Load user-provided cloud configs. May 27 17:00:31.995981 jq[1801]: true May 27 17:00:32.013501 systemd[1]: Started update-engine.service - Update Engine. May 27 17:00:32.019969 update_engine[1786]: I20250527 17:00:32.019865 1786 update_check_scheduler.cc:74] Next update check in 7m32s May 27 17:00:32.032697 systemd[1]: Started locksmithd.service - Cluster reboot manager. May 27 17:00:32.047192 systemd[1]: Finished setup-oem.service - Setup OEM. May 27 17:00:32.095714 bash[1827]: Updated "/home/core/.ssh/authorized_keys" May 27 17:00:32.098281 systemd[1]: Finished update-ssh-keys-after-ignition.service - Run update-ssh-keys once after Ignition. May 27 17:00:32.127205 systemd[1]: Starting sshkeys.service... May 27 17:00:32.157471 extend-filesystems[1769]: Found loop3 May 27 17:00:32.159271 extend-filesystems[1769]: Found loop4 May 27 17:00:32.159271 extend-filesystems[1769]: Found loop5 May 27 17:00:32.159271 extend-filesystems[1769]: Found nvme0n1 May 27 17:00:32.159271 extend-filesystems[1769]: Found nvme0n1p1 May 27 17:00:32.159271 extend-filesystems[1769]: Found nvme0n1p2 May 27 17:00:32.159271 extend-filesystems[1769]: Found nvme0n1p6 May 27 17:00:32.159271 extend-filesystems[1769]: Found nvme0n1p3 May 27 17:00:32.159271 extend-filesystems[1769]: Found usr May 27 17:00:32.159271 extend-filesystems[1769]: Found nvme0n1p4 May 27 17:00:32.159271 extend-filesystems[1769]: Found nvme0n1p7 May 27 17:00:32.159271 extend-filesystems[1769]: Found nvme0n1p9 May 27 17:00:32.164601 systemd[1]: extend-filesystems.service: Deactivated successfully. May 27 17:00:32.165041 systemd[1]: Finished extend-filesystems.service - Extend Filesystems. May 27 17:00:32.235814 systemd[1]: Condition check resulted in dev-ttyS0.device - /dev/ttyS0 being skipped. May 27 17:00:32.248492 systemd[1]: Created slice system-coreos\x2dmetadata\x2dsshkeys.slice - Slice /system/coreos-metadata-sshkeys. May 27 17:00:32.255534 systemd[1]: Starting coreos-metadata-sshkeys@core.service - Flatcar Metadata Agent (SSH Keys)... May 27 17:00:32.345210 ntpd[1771]: ntpd 4.2.8p17@1.4004-o Tue May 27 14:54:38 UTC 2025 (1): Starting May 27 17:00:32.349383 ntpd[1771]: 27 May 17:00:32 ntpd[1771]: ntpd 4.2.8p17@1.4004-o Tue May 27 14:54:38 UTC 2025 (1): Starting May 27 17:00:32.349383 ntpd[1771]: 27 May 17:00:32 ntpd[1771]: Command line: /usr/sbin/ntpd -g -n -u ntp:ntp May 27 17:00:32.349383 ntpd[1771]: 27 May 17:00:32 ntpd[1771]: ---------------------------------------------------- May 27 17:00:32.349383 ntpd[1771]: 27 May 17:00:32 ntpd[1771]: ntp-4 is maintained by Network Time Foundation, May 27 17:00:32.349383 ntpd[1771]: 27 May 17:00:32 ntpd[1771]: Inc. (NTF), a non-profit 501(c)(3) public-benefit May 27 17:00:32.349383 ntpd[1771]: 27 May 17:00:32 ntpd[1771]: corporation. Support and training for ntp-4 are May 27 17:00:32.349383 ntpd[1771]: 27 May 17:00:32 ntpd[1771]: available at https://www.nwtime.org/support May 27 17:00:32.349383 ntpd[1771]: 27 May 17:00:32 ntpd[1771]: ---------------------------------------------------- May 27 17:00:32.345274 ntpd[1771]: Command line: /usr/sbin/ntpd -g -n -u ntp:ntp May 27 17:00:32.345293 ntpd[1771]: ---------------------------------------------------- May 27 17:00:32.352545 ntpd[1771]: 27 May 17:00:32 ntpd[1771]: proto: precision = 0.096 usec (-23) May 27 17:00:32.345310 ntpd[1771]: ntp-4 is maintained by Network Time Foundation, May 27 17:00:32.345327 ntpd[1771]: Inc. (NTF), a non-profit 501(c)(3) public-benefit May 27 17:00:32.345348 ntpd[1771]: corporation. Support and training for ntp-4 are May 27 17:00:32.345365 ntpd[1771]: available at https://www.nwtime.org/support May 27 17:00:32.345382 ntpd[1771]: ---------------------------------------------------- May 27 17:00:32.351697 ntpd[1771]: proto: precision = 0.096 usec (-23) May 27 17:00:32.354100 ntpd[1771]: basedate set to 2025-05-15 May 27 17:00:32.357480 ntpd[1771]: 27 May 17:00:32 ntpd[1771]: basedate set to 2025-05-15 May 27 17:00:32.357480 ntpd[1771]: 27 May 17:00:32 ntpd[1771]: gps base set to 2025-05-18 (week 2367) May 27 17:00:32.354134 ntpd[1771]: gps base set to 2025-05-18 (week 2367) May 27 17:00:32.358225 ntpd[1771]: Listen and drop on 0 v6wildcard [::]:123 May 27 17:00:32.361251 ntpd[1771]: 27 May 17:00:32 ntpd[1771]: Listen and drop on 0 v6wildcard [::]:123 May 27 17:00:32.361251 ntpd[1771]: 27 May 17:00:32 ntpd[1771]: Listen and drop on 1 v4wildcard 0.0.0.0:123 May 27 17:00:32.361251 ntpd[1771]: 27 May 17:00:32 ntpd[1771]: Listen normally on 2 lo 127.0.0.1:123 May 27 17:00:32.361251 ntpd[1771]: 27 May 17:00:32 ntpd[1771]: Listen normally on 3 lo [::1]:123 May 27 17:00:32.361251 ntpd[1771]: 27 May 17:00:32 ntpd[1771]: Listening on routing socket on fd #20 for interface updates May 27 17:00:32.358328 ntpd[1771]: Listen and drop on 1 v4wildcard 0.0.0.0:123 May 27 17:00:32.358612 ntpd[1771]: Listen normally on 2 lo 127.0.0.1:123 May 27 17:00:32.358680 ntpd[1771]: Listen normally on 3 lo [::1]:123 May 27 17:00:32.358746 ntpd[1771]: Listening on routing socket on fd #20 for interface updates May 27 17:00:32.365556 ntpd[1771]: kernel reports TIME_ERROR: 0x41: Clock Unsynchronized May 27 17:00:32.367151 ntpd[1771]: 27 May 17:00:32 ntpd[1771]: kernel reports TIME_ERROR: 0x41: Clock Unsynchronized May 27 17:00:32.367151 ntpd[1771]: 27 May 17:00:32 ntpd[1771]: kernel reports TIME_ERROR: 0x41: Clock Unsynchronized May 27 17:00:32.365621 ntpd[1771]: kernel reports TIME_ERROR: 0x41: Clock Unsynchronized May 27 17:00:32.438189 systemd-networkd[1737]: lo: Link UP May 27 17:00:32.438777 systemd-networkd[1737]: lo: Gained carrier May 27 17:00:32.452120 systemd-networkd[1737]: Enumeration completed May 27 17:00:32.452312 systemd[1]: Started systemd-networkd.service - Network Configuration. May 27 17:00:32.455449 systemd[1]: Reached target network.target - Network. May 27 17:00:32.462602 systemd[1]: Starting containerd.service - containerd container runtime... May 27 17:00:32.462833 locksmithd[1811]: locksmithd starting currentOperation="UPDATE_STATUS_IDLE" strategy="reboot" May 27 17:00:32.475333 systemd-networkd[1737]: eth0: found matching network '/usr/lib/systemd/network/zz-default.network', based on potentially unpredictable interface name. May 27 17:00:32.475350 systemd-networkd[1737]: eth0: Configuring with /usr/lib/systemd/network/zz-default.network. May 27 17:00:32.477489 systemd[1]: Starting systemd-networkd-persistent-storage.service - Enable Persistent Storage in systemd-networkd... May 27 17:00:32.486687 systemd[1]: Starting systemd-networkd-wait-online.service - Wait for Network to be Configured... May 27 17:00:32.493206 systemd-networkd[1737]: eth0: Link UP May 27 17:00:32.493592 systemd-networkd[1737]: eth0: Gained carrier May 27 17:00:32.493626 systemd-networkd[1737]: eth0: found matching network '/usr/lib/systemd/network/zz-default.network', based on potentially unpredictable interface name. May 27 17:00:32.515212 systemd-networkd[1737]: eth0: DHCPv4 address 172.31.23.127/20, gateway 172.31.16.1 acquired from 172.31.16.1 May 27 17:00:32.515382 dbus-daemon[1766]: [system] Activating via systemd: service name='org.freedesktop.hostname1' unit='dbus-org.freedesktop.hostname1.service' requested by ':1.5' (uid=244 pid=1737 comm="/usr/lib/systemd/systemd-networkd" label="system_u:system_r:kernel_t:s0") May 27 17:00:32.527864 systemd[1]: Starting systemd-hostnamed.service - Hostname Service... May 27 17:00:32.585163 systemd-logind[1776]: New seat seat0. May 27 17:00:32.587780 systemd[1]: Started systemd-logind.service - User Login Management. May 27 17:00:32.605201 systemd[1]: Finished systemd-networkd-persistent-storage.service - Enable Persistent Storage in systemd-networkd. May 27 17:00:32.642584 coreos-metadata[1834]: May 27 17:00:32.642 INFO Putting http://169.254.169.254/latest/api/token: Attempt #1 May 27 17:00:32.650383 coreos-metadata[1834]: May 27 17:00:32.649 INFO Fetching http://169.254.169.254/2021-01-03/meta-data/public-keys: Attempt #1 May 27 17:00:32.650383 coreos-metadata[1834]: May 27 17:00:32.649 INFO Fetch successful May 27 17:00:32.650383 coreos-metadata[1834]: May 27 17:00:32.649 INFO Fetching http://169.254.169.254/2021-01-03/meta-data/public-keys/0/openssh-key: Attempt #1 May 27 17:00:32.650383 coreos-metadata[1834]: May 27 17:00:32.649 INFO Fetch successful May 27 17:00:32.654020 unknown[1834]: wrote ssh authorized keys file for user: core May 27 17:00:32.663591 (ntainerd)[1859]: containerd.service: Referenced but unset environment variable evaluates to an empty string: TORCX_IMAGEDIR, TORCX_UNPACKDIR May 27 17:00:32.689480 update-ssh-keys[1864]: Updated "/home/core/.ssh/authorized_keys" May 27 17:00:32.692540 systemd[1]: Finished coreos-metadata-sshkeys@core.service - Flatcar Metadata Agent (SSH Keys). May 27 17:00:32.700355 systemd[1]: Finished sshkeys.service. May 27 17:00:33.031104 coreos-metadata[1764]: May 27 17:00:33.030 INFO Putting http://169.254.169.254/latest/api/token: Attempt #2 May 27 17:00:33.036268 coreos-metadata[1764]: May 27 17:00:33.034 INFO Fetching http://169.254.169.254/2021-01-03/meta-data/instance-id: Attempt #1 May 27 17:00:33.036268 coreos-metadata[1764]: May 27 17:00:33.035 INFO Fetch successful May 27 17:00:33.036268 coreos-metadata[1764]: May 27 17:00:33.035 INFO Fetching http://169.254.169.254/2021-01-03/meta-data/instance-type: Attempt #1 May 27 17:00:33.036268 coreos-metadata[1764]: May 27 17:00:33.035 INFO Fetch successful May 27 17:00:33.036268 coreos-metadata[1764]: May 27 17:00:33.035 INFO Fetching http://169.254.169.254/2021-01-03/meta-data/local-ipv4: Attempt #1 May 27 17:00:33.036268 coreos-metadata[1764]: May 27 17:00:33.035 INFO Fetch successful May 27 17:00:33.036268 coreos-metadata[1764]: May 27 17:00:33.035 INFO Fetching http://169.254.169.254/2021-01-03/meta-data/public-ipv4: Attempt #1 May 27 17:00:33.036268 coreos-metadata[1764]: May 27 17:00:33.035 INFO Fetch successful May 27 17:00:33.036268 coreos-metadata[1764]: May 27 17:00:33.035 INFO Fetching http://169.254.169.254/2021-01-03/meta-data/ipv6: Attempt #1 May 27 17:00:33.036268 coreos-metadata[1764]: May 27 17:00:33.036 INFO Fetch failed with 404: resource not found May 27 17:00:33.036268 coreos-metadata[1764]: May 27 17:00:33.036 INFO Fetching http://169.254.169.254/2021-01-03/meta-data/placement/availability-zone: Attempt #1 May 27 17:00:33.037666 coreos-metadata[1764]: May 27 17:00:33.037 INFO Fetch successful May 27 17:00:33.037666 coreos-metadata[1764]: May 27 17:00:33.037 INFO Fetching http://169.254.169.254/2021-01-03/meta-data/placement/availability-zone-id: Attempt #1 May 27 17:00:33.039996 coreos-metadata[1764]: May 27 17:00:33.038 INFO Fetch successful May 27 17:00:33.039996 coreos-metadata[1764]: May 27 17:00:33.038 INFO Fetching http://169.254.169.254/2021-01-03/meta-data/hostname: Attempt #1 May 27 17:00:33.039996 coreos-metadata[1764]: May 27 17:00:33.039 INFO Fetch successful May 27 17:00:33.040305 coreos-metadata[1764]: May 27 17:00:33.040 INFO Fetching http://169.254.169.254/2021-01-03/meta-data/public-hostname: Attempt #1 May 27 17:00:33.041225 coreos-metadata[1764]: May 27 17:00:33.041 INFO Fetch successful May 27 17:00:33.041225 coreos-metadata[1764]: May 27 17:00:33.041 INFO Fetching http://169.254.169.254/2021-01-03/dynamic/instance-identity/document: Attempt #1 May 27 17:00:33.042173 coreos-metadata[1764]: May 27 17:00:33.042 INFO Fetch successful May 27 17:00:33.075065 systemd[1]: Started systemd-hostnamed.service - Hostname Service. May 27 17:00:33.080300 dbus-daemon[1766]: [system] Successfully activated service 'org.freedesktop.hostname1' May 27 17:00:33.085136 dbus-daemon[1766]: [system] Activating via systemd: service name='org.freedesktop.PolicyKit1' unit='polkit.service' requested by ':1.7' (uid=0 pid=1853 comm="/usr/lib/systemd/systemd-hostnamed" label="system_u:system_r:kernel_t:s0") May 27 17:00:33.098611 systemd[1]: Starting polkit.service - Authorization Manager... May 27 17:00:33.188116 systemd[1]: Finished coreos-metadata.service - Flatcar Metadata Agent. May 27 17:00:33.191077 systemd[1]: packet-phone-home.service - Report Success to Packet was skipped because no trigger condition checks were met. May 27 17:00:33.395064 systemd-logind[1776]: Watching system buttons on /dev/input/event1 (Sleep Button) May 27 17:00:33.404544 systemd-logind[1776]: Watching system buttons on /dev/input/event0 (Power Button) May 27 17:00:33.405323 systemd[1]: Starting systemd-vconsole-setup.service - Virtual Console Setup... May 27 17:00:33.452508 systemd[1]: Found device dev-disk-by\x2dlabel-OEM.device - Amazon Elastic Block Store OEM. May 27 17:00:33.469704 systemd[1]: Starting systemd-fsck@dev-disk-by\x2dlabel-OEM.service - File System Check on /dev/disk/by-label/OEM... May 27 17:00:33.570167 systemd[1]: Finished systemd-fsck@dev-disk-by\x2dlabel-OEM.service - File System Check on /dev/disk/by-label/OEM. May 27 17:00:33.697635 systemd[1]: Finished systemd-vconsole-setup.service - Virtual Console Setup. May 27 17:00:33.779705 polkitd[1937]: Started polkitd version 126 May 27 17:00:33.793352 polkitd[1937]: Loading rules from directory /etc/polkit-1/rules.d May 27 17:00:33.794177 polkitd[1937]: Loading rules from directory /run/polkit-1/rules.d May 27 17:00:33.794362 polkitd[1937]: Error opening rules directory: Error opening directory “/run/polkit-1/rules.d”: No such file or directory (g-file-error-quark, 4) May 27 17:00:33.795080 polkitd[1937]: Loading rules from directory /usr/local/share/polkit-1/rules.d May 27 17:00:33.795212 polkitd[1937]: Error opening rules directory: Error opening directory “/usr/local/share/polkit-1/rules.d”: No such file or directory (g-file-error-quark, 4) May 27 17:00:33.795380 polkitd[1937]: Loading rules from directory /usr/share/polkit-1/rules.d May 27 17:00:33.797019 polkitd[1937]: Finished loading, compiling and executing 2 rules May 27 17:00:33.797687 systemd[1]: Started polkit.service - Authorization Manager. May 27 17:00:33.801305 dbus-daemon[1766]: [system] Successfully activated service 'org.freedesktop.PolicyKit1' May 27 17:00:33.802316 polkitd[1937]: Acquired the name org.freedesktop.PolicyKit1 on the system bus May 27 17:00:33.838131 systemd-hostnamed[1853]: Hostname set to (transient) May 27 17:00:33.838357 systemd-resolved[1684]: System hostname changed to 'ip-172-31-23-127'. May 27 17:00:33.851306 sshd_keygen[1804]: ssh-keygen: generating new host keys: RSA ECDSA ED25519 May 27 17:00:33.900100 systemd[1]: Finished sshd-keygen.service - Generate sshd host keys. May 27 17:00:33.907260 systemd[1]: Starting issuegen.service - Generate /run/issue... May 27 17:00:33.936224 systemd[1]: issuegen.service: Deactivated successfully. May 27 17:00:33.936853 systemd[1]: Finished issuegen.service - Generate /run/issue. May 27 17:00:33.943547 systemd[1]: Starting systemd-user-sessions.service - Permit User Sessions... May 27 17:00:33.983684 systemd[1]: Finished systemd-user-sessions.service - Permit User Sessions. May 27 17:00:33.990368 systemd[1]: Started getty@tty1.service - Getty on tty1. May 27 17:00:33.999311 systemd[1]: Started serial-getty@ttyS0.service - Serial Getty on ttyS0. May 27 17:00:34.002106 systemd[1]: Reached target getty.target - Login Prompts. May 27 17:00:34.403090 ntpd[1771]: giving up resolving host metadata.google.internal: Name or service not known (-2) May 27 17:00:34.403727 ntpd[1771]: 27 May 17:00:34 ntpd[1771]: giving up resolving host metadata.google.internal: Name or service not known (-2) May 27 17:00:34.453229 systemd-networkd[1737]: eth0: Gained IPv6LL May 27 17:00:34.462113 systemd[1]: Finished systemd-networkd-wait-online.service - Wait for Network to be Configured. May 27 17:00:34.465998 systemd[1]: Reached target network-online.target - Network is Online. May 27 17:00:34.471311 systemd[1]: Started amazon-ssm-agent.service - amazon-ssm-agent. May 27 17:00:34.477411 systemd[1]: Starting nvidia.service - NVIDIA Configure Service... May 27 17:00:34.536232 systemd[1]: Finished nvidia.service - NVIDIA Configure Service. May 27 17:00:34.575196 amazon-ssm-agent[1995]: Initializing new seelog logger May 27 17:00:34.575997 amazon-ssm-agent[1995]: New Seelog Logger Creation Complete May 27 17:00:34.575997 amazon-ssm-agent[1995]: 2025/05/27 17:00:34 Found config file at /etc/amazon/ssm/amazon-ssm-agent.json. May 27 17:00:34.575997 amazon-ssm-agent[1995]: Applying config override from /etc/amazon/ssm/amazon-ssm-agent.json. May 27 17:00:34.576732 amazon-ssm-agent[1995]: 2025/05/27 17:00:34 processing appconfig overrides May 27 17:00:34.577453 amazon-ssm-agent[1995]: 2025/05/27 17:00:34 Found config file at /etc/amazon/ssm/amazon-ssm-agent.json. May 27 17:00:34.577568 amazon-ssm-agent[1995]: Applying config override from /etc/amazon/ssm/amazon-ssm-agent.json. May 27 17:00:34.577791 amazon-ssm-agent[1995]: 2025/05/27 17:00:34 processing appconfig overrides May 27 17:00:34.578211 amazon-ssm-agent[1995]: 2025/05/27 17:00:34 Found config file at /etc/amazon/ssm/amazon-ssm-agent.json. May 27 17:00:34.578301 amazon-ssm-agent[1995]: Applying config override from /etc/amazon/ssm/amazon-ssm-agent.json. May 27 17:00:34.578512 amazon-ssm-agent[1995]: 2025/05/27 17:00:34 processing appconfig overrides May 27 17:00:34.579421 amazon-ssm-agent[1995]: 2025-05-27 17:00:34.5773 INFO Proxy environment variables: May 27 17:00:34.582371 amazon-ssm-agent[1995]: 2025/05/27 17:00:34 Found config file at /etc/amazon/ssm/amazon-ssm-agent.json. May 27 17:00:34.582523 amazon-ssm-agent[1995]: Applying config override from /etc/amazon/ssm/amazon-ssm-agent.json. May 27 17:00:34.582866 amazon-ssm-agent[1995]: 2025/05/27 17:00:34 processing appconfig overrides May 27 17:00:34.679297 amazon-ssm-agent[1995]: 2025-05-27 17:00:34.5773 INFO https_proxy: May 27 17:00:34.777765 amazon-ssm-agent[1995]: 2025-05-27 17:00:34.5773 INFO http_proxy: May 27 17:00:34.876061 amazon-ssm-agent[1995]: 2025-05-27 17:00:34.5773 INFO no_proxy: May 27 17:00:34.955795 amazon-ssm-agent[1995]: 2025/05/27 17:00:34 Found config file at /etc/amazon/ssm/amazon-ssm-agent.json. May 27 17:00:34.955795 amazon-ssm-agent[1995]: Applying config override from /etc/amazon/ssm/amazon-ssm-agent.json. May 27 17:00:34.955973 amazon-ssm-agent[1995]: 2025/05/27 17:00:34 processing appconfig overrides May 27 17:00:34.974319 amazon-ssm-agent[1995]: 2025-05-27 17:00:34.5779 INFO Checking if agent identity type OnPrem can be assumed May 27 17:00:34.988345 amazon-ssm-agent[1995]: 2025-05-27 17:00:34.5780 INFO Checking if agent identity type EC2 can be assumed May 27 17:00:34.988345 amazon-ssm-agent[1995]: 2025-05-27 17:00:34.6390 INFO Agent will take identity from EC2 May 27 17:00:34.988345 amazon-ssm-agent[1995]: 2025-05-27 17:00:34.6411 INFO [amazon-ssm-agent] amazon-ssm-agent - v3.3.0.0 May 27 17:00:34.988345 amazon-ssm-agent[1995]: 2025-05-27 17:00:34.6417 INFO [amazon-ssm-agent] OS: linux, Arch: arm64 May 27 17:00:34.988345 amazon-ssm-agent[1995]: 2025-05-27 17:00:34.6417 INFO [amazon-ssm-agent] Starting Core Agent May 27 17:00:34.988345 amazon-ssm-agent[1995]: 2025-05-27 17:00:34.6418 INFO [amazon-ssm-agent] Registrar detected. Attempting registration May 27 17:00:34.988715 amazon-ssm-agent[1995]: 2025-05-27 17:00:34.6418 INFO [Registrar] Starting registrar module May 27 17:00:34.988715 amazon-ssm-agent[1995]: 2025-05-27 17:00:34.6439 INFO [EC2Identity] Checking disk for registration info May 27 17:00:34.988715 amazon-ssm-agent[1995]: 2025-05-27 17:00:34.6440 INFO [EC2Identity] No registration info found for ec2 instance, attempting registration May 27 17:00:34.988715 amazon-ssm-agent[1995]: 2025-05-27 17:00:34.6440 INFO [EC2Identity] Generating registration keypair May 27 17:00:34.988715 amazon-ssm-agent[1995]: 2025-05-27 17:00:34.9103 INFO [EC2Identity] Checking write access before registering May 27 17:00:34.988715 amazon-ssm-agent[1995]: 2025-05-27 17:00:34.9113 INFO [EC2Identity] Registering EC2 instance with Systems Manager May 27 17:00:34.988715 amazon-ssm-agent[1995]: 2025-05-27 17:00:34.9554 INFO [EC2Identity] EC2 registration was successful. May 27 17:00:34.988715 amazon-ssm-agent[1995]: 2025-05-27 17:00:34.9554 INFO [amazon-ssm-agent] Registration attempted. Resuming core agent startup. May 27 17:00:34.988715 amazon-ssm-agent[1995]: 2025-05-27 17:00:34.9556 INFO [CredentialRefresher] credentialRefresher has started May 27 17:00:34.988715 amazon-ssm-agent[1995]: 2025-05-27 17:00:34.9556 INFO [CredentialRefresher] Starting credentials refresher loop May 27 17:00:34.988715 amazon-ssm-agent[1995]: 2025-05-27 17:00:34.9878 INFO EC2RoleProvider Successfully connected with instance profile role credentials May 27 17:00:34.988715 amazon-ssm-agent[1995]: 2025-05-27 17:00:34.9882 INFO [CredentialRefresher] Credentials ready May 27 17:00:35.072130 amazon-ssm-agent[1995]: 2025-05-27 17:00:34.9886 INFO [CredentialRefresher] Next credential rotation will be in 29.9999868675 minutes May 27 17:00:35.364469 containerd[1859]: time="2025-05-27T17:00:35Z" level=warning msg="Ignoring unknown key in TOML" column=1 error="strict mode: fields in the document are missing in the target struct" file=/usr/share/containerd/config.toml key=subreaper row=8 May 27 17:00:35.368211 containerd[1859]: time="2025-05-27T17:00:35.368122389Z" level=info msg="starting containerd" revision=06b99ca80cdbfbc6cc8bd567021738c9af2b36ce version=v2.0.4 May 27 17:00:35.384189 containerd[1859]: time="2025-05-27T17:00:35.384119985Z" level=warning msg="Configuration migrated from version 2, use `containerd config migrate` to avoid migration" t="14.568µs" May 27 17:00:35.385017 containerd[1859]: time="2025-05-27T17:00:35.384366129Z" level=info msg="loading plugin" id=io.containerd.image-verifier.v1.bindir type=io.containerd.image-verifier.v1 May 27 17:00:35.385017 containerd[1859]: time="2025-05-27T17:00:35.384410181Z" level=info msg="loading plugin" id=io.containerd.internal.v1.opt type=io.containerd.internal.v1 May 27 17:00:35.385017 containerd[1859]: time="2025-05-27T17:00:35.384736473Z" level=info msg="loading plugin" id=io.containerd.warning.v1.deprecations type=io.containerd.warning.v1 May 27 17:00:35.385017 containerd[1859]: time="2025-05-27T17:00:35.384769197Z" level=info msg="loading plugin" id=io.containerd.content.v1.content type=io.containerd.content.v1 May 27 17:00:35.385017 containerd[1859]: time="2025-05-27T17:00:35.384825441Z" level=info msg="loading plugin" id=io.containerd.snapshotter.v1.blockfile type=io.containerd.snapshotter.v1 May 27 17:00:35.385017 containerd[1859]: time="2025-05-27T17:00:35.384934653Z" level=info msg="skip loading plugin" error="no scratch file generator: skip plugin" id=io.containerd.snapshotter.v1.blockfile type=io.containerd.snapshotter.v1 May 27 17:00:35.385017 containerd[1859]: time="2025-05-27T17:00:35.385014825Z" level=info msg="loading plugin" id=io.containerd.snapshotter.v1.btrfs type=io.containerd.snapshotter.v1 May 27 17:00:35.385528 containerd[1859]: time="2025-05-27T17:00:35.385456101Z" level=info msg="skip loading plugin" 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" id=io.containerd.snapshotter.v1.btrfs type=io.containerd.snapshotter.v1 May 27 17:00:35.385528 containerd[1859]: time="2025-05-27T17:00:35.385513089Z" level=info msg="loading plugin" id=io.containerd.snapshotter.v1.devmapper type=io.containerd.snapshotter.v1 May 27 17:00:35.385647 containerd[1859]: time="2025-05-27T17:00:35.385546125Z" level=info msg="skip loading plugin" error="devmapper not configured: skip plugin" id=io.containerd.snapshotter.v1.devmapper type=io.containerd.snapshotter.v1 May 27 17:00:35.385647 containerd[1859]: time="2025-05-27T17:00:35.385569717Z" level=info msg="loading plugin" id=io.containerd.snapshotter.v1.native type=io.containerd.snapshotter.v1 May 27 17:00:35.385800 containerd[1859]: time="2025-05-27T17:00:35.385750149Z" level=info msg="loading plugin" id=io.containerd.snapshotter.v1.overlayfs type=io.containerd.snapshotter.v1 May 27 17:00:35.386319 containerd[1859]: time="2025-05-27T17:00:35.386251905Z" level=info msg="loading plugin" id=io.containerd.snapshotter.v1.zfs type=io.containerd.snapshotter.v1 May 27 17:00:35.386432 containerd[1859]: time="2025-05-27T17:00:35.386354133Z" level=info msg="skip loading plugin" error="lstat /var/lib/containerd/io.containerd.snapshotter.v1.zfs: no such file or directory: skip plugin" id=io.containerd.snapshotter.v1.zfs type=io.containerd.snapshotter.v1 May 27 17:00:35.386432 containerd[1859]: time="2025-05-27T17:00:35.386400969Z" level=info msg="loading plugin" id=io.containerd.event.v1.exchange type=io.containerd.event.v1 May 27 17:00:35.386557 containerd[1859]: time="2025-05-27T17:00:35.386499129Z" level=info msg="loading plugin" id=io.containerd.monitor.task.v1.cgroups type=io.containerd.monitor.task.v1 May 27 17:00:35.387092 containerd[1859]: time="2025-05-27T17:00:35.387048249Z" level=info msg="loading plugin" id=io.containerd.metadata.v1.bolt type=io.containerd.metadata.v1 May 27 17:00:35.387257 containerd[1859]: time="2025-05-27T17:00:35.387221277Z" level=info msg="metadata content store policy set" policy=shared May 27 17:00:35.397018 containerd[1859]: time="2025-05-27T17:00:35.396907869Z" level=info msg="loading plugin" id=io.containerd.gc.v1.scheduler type=io.containerd.gc.v1 May 27 17:00:35.397185 containerd[1859]: time="2025-05-27T17:00:35.397060785Z" level=info msg="loading plugin" id=io.containerd.differ.v1.walking type=io.containerd.differ.v1 May 27 17:00:35.397185 containerd[1859]: time="2025-05-27T17:00:35.397171353Z" level=info msg="loading plugin" id=io.containerd.lease.v1.manager type=io.containerd.lease.v1 May 27 17:00:35.397292 containerd[1859]: time="2025-05-27T17:00:35.397208481Z" level=info msg="loading plugin" id=io.containerd.service.v1.containers-service type=io.containerd.service.v1 May 27 17:00:35.397292 containerd[1859]: time="2025-05-27T17:00:35.397237773Z" level=info msg="loading plugin" id=io.containerd.service.v1.content-service type=io.containerd.service.v1 May 27 17:00:35.397292 containerd[1859]: time="2025-05-27T17:00:35.397265265Z" level=info msg="loading plugin" id=io.containerd.service.v1.diff-service type=io.containerd.service.v1 May 27 17:00:35.397427 containerd[1859]: time="2025-05-27T17:00:35.397294617Z" level=info msg="loading plugin" id=io.containerd.service.v1.images-service type=io.containerd.service.v1 May 27 17:00:35.397427 containerd[1859]: time="2025-05-27T17:00:35.397324977Z" level=info msg="loading plugin" id=io.containerd.service.v1.introspection-service type=io.containerd.service.v1 May 27 17:00:35.397427 containerd[1859]: time="2025-05-27T17:00:35.397355001Z" level=info msg="loading plugin" id=io.containerd.service.v1.namespaces-service type=io.containerd.service.v1 May 27 17:00:35.397427 containerd[1859]: time="2025-05-27T17:00:35.397381365Z" level=info msg="loading plugin" id=io.containerd.service.v1.snapshots-service type=io.containerd.service.v1 May 27 17:00:35.397427 containerd[1859]: time="2025-05-27T17:00:35.397404933Z" level=info msg="loading plugin" id=io.containerd.shim.v1.manager type=io.containerd.shim.v1 May 27 17:00:35.397656 containerd[1859]: time="2025-05-27T17:00:35.397434165Z" level=info msg="loading plugin" id=io.containerd.runtime.v2.task type=io.containerd.runtime.v2 May 27 17:00:35.397708 containerd[1859]: time="2025-05-27T17:00:35.397683129Z" level=info msg="loading plugin" id=io.containerd.service.v1.tasks-service type=io.containerd.service.v1 May 27 17:00:35.397808 containerd[1859]: time="2025-05-27T17:00:35.397723881Z" level=info msg="loading plugin" id=io.containerd.grpc.v1.containers type=io.containerd.grpc.v1 May 27 17:00:35.397872 containerd[1859]: time="2025-05-27T17:00:35.397814949Z" level=info msg="loading plugin" id=io.containerd.grpc.v1.content type=io.containerd.grpc.v1 May 27 17:00:35.397872 containerd[1859]: time="2025-05-27T17:00:35.397847073Z" level=info msg="loading plugin" id=io.containerd.grpc.v1.diff type=io.containerd.grpc.v1 May 27 17:00:35.397994 containerd[1859]: time="2025-05-27T17:00:35.397874205Z" level=info msg="loading plugin" id=io.containerd.grpc.v1.events type=io.containerd.grpc.v1 May 27 17:00:35.397994 containerd[1859]: time="2025-05-27T17:00:35.397901517Z" level=info msg="loading plugin" id=io.containerd.grpc.v1.images type=io.containerd.grpc.v1 May 27 17:00:35.397994 containerd[1859]: time="2025-05-27T17:00:35.397930593Z" level=info msg="loading plugin" id=io.containerd.grpc.v1.introspection type=io.containerd.grpc.v1 May 27 17:00:35.398147 containerd[1859]: time="2025-05-27T17:00:35.397991745Z" level=info msg="loading plugin" id=io.containerd.grpc.v1.leases type=io.containerd.grpc.v1 May 27 17:00:35.398147 containerd[1859]: time="2025-05-27T17:00:35.398033445Z" level=info msg="loading plugin" id=io.containerd.grpc.v1.namespaces type=io.containerd.grpc.v1 May 27 17:00:35.398147 containerd[1859]: time="2025-05-27T17:00:35.398062641Z" level=info msg="loading plugin" id=io.containerd.sandbox.store.v1.local type=io.containerd.sandbox.store.v1 May 27 17:00:35.398147 containerd[1859]: time="2025-05-27T17:00:35.398103237Z" level=info msg="loading plugin" id=io.containerd.cri.v1.images type=io.containerd.cri.v1 May 27 17:00:35.398336 containerd[1859]: time="2025-05-27T17:00:35.398259538Z" level=info msg="Get image filesystem path \"/var/lib/containerd/io.containerd.snapshotter.v1.overlayfs\" for snapshotter \"overlayfs\"" May 27 17:00:35.398336 containerd[1859]: time="2025-05-27T17:00:35.398292142Z" level=info msg="Start snapshots syncer" May 27 17:00:35.398463 containerd[1859]: time="2025-05-27T17:00:35.398369782Z" level=info msg="loading plugin" id=io.containerd.cri.v1.runtime type=io.containerd.cri.v1 May 27 17:00:35.399052 containerd[1859]: time="2025-05-27T17:00:35.398926822Z" level=info msg="starting cri plugin" config="{\"containerd\":{\"defaultRuntimeName\":\"runc\",\"runtimes\":{\"runc\":{\"runtimeType\":\"io.containerd.runc.v2\",\"runtimePath\":\"\",\"PodAnnotations\":null,\"ContainerAnnotations\":null,\"options\":{\"BinaryName\":\"\",\"CriuImagePath\":\"\",\"CriuWorkPath\":\"\",\"IoGid\":0,\"IoUid\":0,\"NoNewKeyring\":false,\"Root\":\"\",\"ShimCgroup\":\"\",\"SystemdCgroup\":true},\"privileged_without_host_devices\":false,\"privileged_without_host_devices_all_devices_allowed\":false,\"baseRuntimeSpec\":\"\",\"cniConfDir\":\"\",\"cniMaxConfNum\":0,\"snapshotter\":\"\",\"sandboxer\":\"podsandbox\",\"io_type\":\"\"}},\"ignoreBlockIONotEnabledErrors\":false,\"ignoreRdtNotEnabledErrors\":false},\"cni\":{\"binDir\":\"/opt/cni/bin\",\"confDir\":\"/etc/cni/net.d\",\"maxConfNum\":1,\"setupSerially\":false,\"confTemplate\":\"\",\"ipPref\":\"\",\"useInternalLoopback\":false},\"enableSelinux\":true,\"selinuxCategoryRange\":1024,\"maxContainerLogSize\":16384,\"disableApparmor\":false,\"restrictOOMScoreAdj\":false,\"disableProcMount\":false,\"unsetSeccompProfile\":\"\",\"tolerateMissingHugetlbController\":true,\"disableHugetlbController\":true,\"device_ownership_from_security_context\":false,\"ignoreImageDefinedVolumes\":false,\"netnsMountsUnderStateDir\":false,\"enableUnprivilegedPorts\":true,\"enableUnprivilegedICMP\":true,\"enableCDI\":true,\"cdiSpecDirs\":[\"/etc/cdi\",\"/var/run/cdi\"],\"drainExecSyncIOTimeout\":\"0s\",\"ignoreDeprecationWarnings\":null,\"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\"}" May 27 17:00:35.399283 containerd[1859]: time="2025-05-27T17:00:35.399078346Z" level=info msg="loading plugin" id=io.containerd.podsandbox.controller.v1.podsandbox type=io.containerd.podsandbox.controller.v1 May 27 17:00:35.399283 containerd[1859]: time="2025-05-27T17:00:35.399223978Z" level=info msg="loading plugin" id=io.containerd.sandbox.controller.v1.shim type=io.containerd.sandbox.controller.v1 May 27 17:00:35.399539 containerd[1859]: time="2025-05-27T17:00:35.399486982Z" level=info msg="loading plugin" id=io.containerd.grpc.v1.sandbox-controllers type=io.containerd.grpc.v1 May 27 17:00:35.399619 containerd[1859]: time="2025-05-27T17:00:35.399547270Z" level=info msg="loading plugin" id=io.containerd.grpc.v1.sandboxes type=io.containerd.grpc.v1 May 27 17:00:35.399619 containerd[1859]: time="2025-05-27T17:00:35.399592402Z" level=info msg="loading plugin" id=io.containerd.grpc.v1.snapshots type=io.containerd.grpc.v1 May 27 17:00:35.399778 containerd[1859]: time="2025-05-27T17:00:35.399620998Z" level=info msg="loading plugin" id=io.containerd.streaming.v1.manager type=io.containerd.streaming.v1 May 27 17:00:35.399778 containerd[1859]: time="2025-05-27T17:00:35.399650458Z" level=info msg="loading plugin" id=io.containerd.grpc.v1.streaming type=io.containerd.grpc.v1 May 27 17:00:35.399778 containerd[1859]: time="2025-05-27T17:00:35.399679078Z" level=info msg="loading plugin" id=io.containerd.grpc.v1.tasks type=io.containerd.grpc.v1 May 27 17:00:35.399778 containerd[1859]: time="2025-05-27T17:00:35.399705922Z" level=info msg="loading plugin" id=io.containerd.transfer.v1.local type=io.containerd.transfer.v1 May 27 17:00:35.399778 containerd[1859]: time="2025-05-27T17:00:35.399769678Z" level=info msg="loading plugin" id=io.containerd.grpc.v1.transfer type=io.containerd.grpc.v1 May 27 17:00:35.400157 containerd[1859]: time="2025-05-27T17:00:35.399798586Z" level=info msg="loading plugin" id=io.containerd.grpc.v1.version type=io.containerd.grpc.v1 May 27 17:00:35.400157 containerd[1859]: time="2025-05-27T17:00:35.399826498Z" level=info msg="loading plugin" id=io.containerd.monitor.container.v1.restart type=io.containerd.monitor.container.v1 May 27 17:00:35.400157 containerd[1859]: time="2025-05-27T17:00:35.399914722Z" level=info msg="loading plugin" id=io.containerd.tracing.processor.v1.otlp type=io.containerd.tracing.processor.v1 May 27 17:00:35.400157 containerd[1859]: time="2025-05-27T17:00:35.399969250Z" level=info msg="skip loading plugin" error="skip plugin: tracing endpoint not configured" id=io.containerd.tracing.processor.v1.otlp type=io.containerd.tracing.processor.v1 May 27 17:00:35.400157 containerd[1859]: time="2025-05-27T17:00:35.399996454Z" level=info msg="loading plugin" id=io.containerd.internal.v1.tracing type=io.containerd.internal.v1 May 27 17:00:35.400157 containerd[1859]: time="2025-05-27T17:00:35.400022494Z" level=info msg="skip loading plugin" error="skip plugin: tracing endpoint not configured" id=io.containerd.internal.v1.tracing type=io.containerd.internal.v1 May 27 17:00:35.400157 containerd[1859]: time="2025-05-27T17:00:35.400043206Z" level=info msg="loading plugin" id=io.containerd.ttrpc.v1.otelttrpc type=io.containerd.ttrpc.v1 May 27 17:00:35.400157 containerd[1859]: time="2025-05-27T17:00:35.400075954Z" level=info msg="loading plugin" id=io.containerd.grpc.v1.healthcheck type=io.containerd.grpc.v1 May 27 17:00:35.400157 containerd[1859]: time="2025-05-27T17:00:35.400103746Z" level=info msg="loading plugin" id=io.containerd.nri.v1.nri type=io.containerd.nri.v1 May 27 17:00:35.400798 containerd[1859]: time="2025-05-27T17:00:35.400170118Z" level=info msg="runtime interface created" May 27 17:00:35.400798 containerd[1859]: time="2025-05-27T17:00:35.400185826Z" level=info msg="created NRI interface" May 27 17:00:35.400798 containerd[1859]: time="2025-05-27T17:00:35.400210498Z" level=info msg="loading plugin" id=io.containerd.grpc.v1.cri type=io.containerd.grpc.v1 May 27 17:00:35.400798 containerd[1859]: time="2025-05-27T17:00:35.400239958Z" level=info msg="Connect containerd service" May 27 17:00:35.400798 containerd[1859]: time="2025-05-27T17:00:35.400307830Z" level=info msg="using experimental NRI integration - disable nri plugin to prevent this" May 27 17:00:35.401830 containerd[1859]: time="2025-05-27T17:00:35.401756542Z" 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" May 27 17:00:35.563666 containerd[1859]: time="2025-05-27T17:00:35.563597482Z" level=info msg=serving... address=/run/containerd/containerd.sock.ttrpc May 27 17:00:35.563796 containerd[1859]: time="2025-05-27T17:00:35.563736262Z" level=info msg=serving... address=/run/containerd/containerd.sock May 27 17:00:35.563846 containerd[1859]: time="2025-05-27T17:00:35.563795074Z" level=info msg="Start subscribing containerd event" May 27 17:00:35.563922 containerd[1859]: time="2025-05-27T17:00:35.563855938Z" level=info msg="Start recovering state" May 27 17:00:35.565269 containerd[1859]: time="2025-05-27T17:00:35.565136902Z" level=info msg="Start event monitor" May 27 17:00:35.565269 containerd[1859]: time="2025-05-27T17:00:35.565207510Z" level=info msg="Start cni network conf syncer for default" May 27 17:00:35.565269 containerd[1859]: time="2025-05-27T17:00:35.565229746Z" level=info msg="Start streaming server" May 27 17:00:35.565558 containerd[1859]: time="2025-05-27T17:00:35.565471186Z" level=info msg="Registered namespace \"k8s.io\" with NRI" May 27 17:00:35.565558 containerd[1859]: time="2025-05-27T17:00:35.565497706Z" level=info msg="runtime interface starting up..." May 27 17:00:35.565558 containerd[1859]: time="2025-05-27T17:00:35.565513822Z" level=info msg="starting plugins..." May 27 17:00:35.566193 containerd[1859]: time="2025-05-27T17:00:35.566068054Z" level=info msg="Synchronizing NRI (plugin) with current runtime state" May 27 17:00:35.566704 systemd[1]: Started containerd.service - containerd container runtime. May 27 17:00:35.567432 containerd[1859]: time="2025-05-27T17:00:35.566820658Z" level=info msg="containerd successfully booted in 0.203158s" May 27 17:00:35.570670 systemd[1]: Reached target multi-user.target - Multi-User System. May 27 17:00:35.577125 systemd[1]: Startup finished in 3.807s (kernel) + 6.877s (initrd) + 8.069s (userspace) = 18.755s. May 27 17:00:35.711645 systemd[1]: Created slice system-sshd.slice - Slice /system/sshd. May 27 17:00:35.714369 systemd[1]: Started sshd@0-172.31.23.127:22-139.178.68.195:37520.service - OpenSSH per-connection server daemon (139.178.68.195:37520). May 27 17:00:35.928362 sshd[2034]: Accepted publickey for core from 139.178.68.195 port 37520 ssh2: RSA SHA256:zVfNVfC8v+Xfrinjy7jCJIf2+ESFz7qymQmXWOreRws May 27 17:00:35.932016 sshd-session[2034]: pam_unix(sshd:session): session opened for user core(uid=500) by core(uid=0) May 27 17:00:35.951992 systemd[1]: Created slice user-500.slice - User Slice of UID 500. May 27 17:00:35.954543 systemd[1]: Starting user-runtime-dir@500.service - User Runtime Directory /run/user/500... May 27 17:00:35.962646 systemd-logind[1776]: New session 1 of user core. May 27 17:00:35.993887 systemd[1]: Finished user-runtime-dir@500.service - User Runtime Directory /run/user/500. May 27 17:00:36.003438 systemd[1]: Starting user@500.service - User Manager for UID 500... May 27 17:00:36.021879 (systemd)[2040]: pam_unix(systemd-user:session): session opened for user core(uid=500) by (uid=0) May 27 17:00:36.023808 amazon-ssm-agent[1995]: 2025-05-27 17:00:36.0213 INFO [amazon-ssm-agent] [LongRunningWorkerContainer] [WorkerProvider] Worker ssm-agent-worker is not running, starting worker process May 27 17:00:36.028595 systemd-logind[1776]: New session c1 of user core. May 27 17:00:36.125225 amazon-ssm-agent[1995]: 2025-05-27 17:00:36.0277 INFO [amazon-ssm-agent] [LongRunningWorkerContainer] [WorkerProvider] Worker ssm-agent-worker (pid:2041) started May 27 17:00:36.225728 amazon-ssm-agent[1995]: 2025-05-27 17:00:36.0277 INFO [amazon-ssm-agent] [LongRunningWorkerContainer] Monitor long running worker health every 60 seconds May 27 17:00:36.362876 systemd[2040]: Queued start job for default target default.target. May 27 17:00:36.384293 systemd[2040]: Created slice app.slice - User Application Slice. May 27 17:00:36.384551 systemd[2040]: Reached target paths.target - Paths. May 27 17:00:36.384888 systemd[2040]: Reached target timers.target - Timers. May 27 17:00:36.387864 systemd[2040]: Starting dbus.socket - D-Bus User Message Bus Socket... May 27 17:00:36.423395 systemd[2040]: Listening on dbus.socket - D-Bus User Message Bus Socket. May 27 17:00:36.423928 systemd[2040]: Reached target sockets.target - Sockets. May 27 17:00:36.424280 systemd[2040]: Reached target basic.target - Basic System. May 27 17:00:36.424497 systemd[2040]: Reached target default.target - Main User Target. May 27 17:00:36.424556 systemd[1]: Started user@500.service - User Manager for UID 500. May 27 17:00:36.424873 systemd[2040]: Startup finished in 380ms. May 27 17:00:36.437274 systemd[1]: Started session-1.scope - Session 1 of User core. May 27 17:00:36.600438 systemd[1]: Started sshd@1-172.31.23.127:22-139.178.68.195:37536.service - OpenSSH per-connection server daemon (139.178.68.195:37536). May 27 17:00:36.809131 sshd[2062]: Accepted publickey for core from 139.178.68.195 port 37536 ssh2: RSA SHA256:zVfNVfC8v+Xfrinjy7jCJIf2+ESFz7qymQmXWOreRws May 27 17:00:36.812150 sshd-session[2062]: pam_unix(sshd:session): session opened for user core(uid=500) by core(uid=0) May 27 17:00:36.820856 systemd-logind[1776]: New session 2 of user core. May 27 17:00:36.840237 systemd[1]: Started session-2.scope - Session 2 of User core. May 27 17:00:36.968368 sshd[2064]: Connection closed by 139.178.68.195 port 37536 May 27 17:00:36.969189 sshd-session[2062]: pam_unix(sshd:session): session closed for user core May 27 17:00:36.976437 systemd[1]: sshd@1-172.31.23.127:22-139.178.68.195:37536.service: Deactivated successfully. May 27 17:00:36.980549 systemd[1]: session-2.scope: Deactivated successfully. May 27 17:00:36.982437 systemd-logind[1776]: Session 2 logged out. Waiting for processes to exit. May 27 17:00:36.985773 systemd-logind[1776]: Removed session 2. May 27 17:00:37.004914 systemd[1]: Started sshd@2-172.31.23.127:22-139.178.68.195:37548.service - OpenSSH per-connection server daemon (139.178.68.195:37548). May 27 17:00:37.216506 sshd[2070]: Accepted publickey for core from 139.178.68.195 port 37548 ssh2: RSA SHA256:zVfNVfC8v+Xfrinjy7jCJIf2+ESFz7qymQmXWOreRws May 27 17:00:37.219211 sshd-session[2070]: pam_unix(sshd:session): session opened for user core(uid=500) by core(uid=0) May 27 17:00:37.227914 systemd-logind[1776]: New session 3 of user core. May 27 17:00:37.242225 systemd[1]: Started session-3.scope - Session 3 of User core. May 27 17:00:37.346089 ntpd[1771]: Listen normally on 4 eth0 172.31.23.127:123 May 27 17:00:37.346212 ntpd[1771]: Listen normally on 5 eth0 [fe80::453:b2ff:fe55:b75%2]:123 May 27 17:00:37.346729 ntpd[1771]: 27 May 17:00:37 ntpd[1771]: Listen normally on 4 eth0 172.31.23.127:123 May 27 17:00:37.346729 ntpd[1771]: 27 May 17:00:37 ntpd[1771]: Listen normally on 5 eth0 [fe80::453:b2ff:fe55:b75%2]:123 May 27 17:00:37.361105 sshd[2072]: Connection closed by 139.178.68.195 port 37548 May 27 17:00:37.361929 sshd-session[2070]: pam_unix(sshd:session): session closed for user core May 27 17:00:37.369697 systemd[1]: sshd@2-172.31.23.127:22-139.178.68.195:37548.service: Deactivated successfully. May 27 17:00:37.374754 systemd[1]: session-3.scope: Deactivated successfully. May 27 17:00:37.378609 systemd-logind[1776]: Session 3 logged out. Waiting for processes to exit. May 27 17:00:37.398664 systemd-logind[1776]: Removed session 3. May 27 17:00:37.400372 systemd[1]: Started sshd@3-172.31.23.127:22-139.178.68.195:37564.service - OpenSSH per-connection server daemon (139.178.68.195:37564). May 27 17:00:37.601217 sshd[2078]: Accepted publickey for core from 139.178.68.195 port 37564 ssh2: RSA SHA256:zVfNVfC8v+Xfrinjy7jCJIf2+ESFz7qymQmXWOreRws May 27 17:00:37.604311 sshd-session[2078]: pam_unix(sshd:session): session opened for user core(uid=500) by core(uid=0) May 27 17:00:37.613138 systemd-logind[1776]: New session 4 of user core. May 27 17:00:37.624252 systemd[1]: Started session-4.scope - Session 4 of User core. May 27 17:00:37.750187 sshd[2080]: Connection closed by 139.178.68.195 port 37564 May 27 17:00:37.750715 sshd-session[2078]: pam_unix(sshd:session): session closed for user core May 27 17:00:37.757860 systemd[1]: sshd@3-172.31.23.127:22-139.178.68.195:37564.service: Deactivated successfully. May 27 17:00:37.761188 systemd[1]: session-4.scope: Deactivated successfully. May 27 17:00:37.762825 systemd-logind[1776]: Session 4 logged out. Waiting for processes to exit. May 27 17:00:37.765348 systemd-logind[1776]: Removed session 4. May 27 17:00:37.791537 systemd[1]: Started sshd@4-172.31.23.127:22-139.178.68.195:37568.service - OpenSSH per-connection server daemon (139.178.68.195:37568). May 27 17:00:37.995196 sshd[2086]: Accepted publickey for core from 139.178.68.195 port 37568 ssh2: RSA SHA256:zVfNVfC8v+Xfrinjy7jCJIf2+ESFz7qymQmXWOreRws May 27 17:00:37.998177 sshd-session[2086]: pam_unix(sshd:session): session opened for user core(uid=500) by core(uid=0) May 27 17:00:38.008050 systemd-logind[1776]: New session 5 of user core. May 27 17:00:38.014233 systemd[1]: Started session-5.scope - Session 5 of User core. May 27 17:00:38.129465 sudo[2089]: core : PWD=/home/core ; USER=root ; COMMAND=/usr/sbin/setenforce 1 May 27 17:00:38.130570 sudo[2089]: pam_unix(sudo:session): session opened for user root(uid=0) by core(uid=500) May 27 17:00:38.145579 sudo[2089]: pam_unix(sudo:session): session closed for user root May 27 17:00:38.168603 sshd[2088]: Connection closed by 139.178.68.195 port 37568 May 27 17:00:38.169737 sshd-session[2086]: pam_unix(sshd:session): session closed for user core May 27 17:00:38.177415 systemd-logind[1776]: Session 5 logged out. Waiting for processes to exit. May 27 17:00:38.179424 systemd[1]: sshd@4-172.31.23.127:22-139.178.68.195:37568.service: Deactivated successfully. May 27 17:00:38.183655 systemd[1]: session-5.scope: Deactivated successfully. May 27 17:00:38.187931 systemd-logind[1776]: Removed session 5. May 27 17:00:38.207187 systemd[1]: Started sshd@5-172.31.23.127:22-139.178.68.195:37576.service - OpenSSH per-connection server daemon (139.178.68.195:37576). May 27 17:00:38.407922 sshd[2095]: Accepted publickey for core from 139.178.68.195 port 37576 ssh2: RSA SHA256:zVfNVfC8v+Xfrinjy7jCJIf2+ESFz7qymQmXWOreRws May 27 17:00:38.410740 sshd-session[2095]: pam_unix(sshd:session): session opened for user core(uid=500) by core(uid=0) May 27 17:00:38.420047 systemd-logind[1776]: New session 6 of user core. May 27 17:00:38.427214 systemd[1]: Started session-6.scope - Session 6 of User core. May 27 17:00:38.531802 sudo[2099]: core : PWD=/home/core ; USER=root ; COMMAND=/usr/sbin/rm -rf /etc/audit/rules.d/80-selinux.rules /etc/audit/rules.d/99-default.rules May 27 17:00:38.533033 sudo[2099]: pam_unix(sudo:session): session opened for user root(uid=0) by core(uid=500) May 27 17:00:38.542409 sudo[2099]: pam_unix(sudo:session): session closed for user root May 27 17:00:38.552328 sudo[2098]: core : PWD=/home/core ; USER=root ; COMMAND=/usr/sbin/systemctl restart audit-rules May 27 17:00:38.552962 sudo[2098]: pam_unix(sudo:session): session opened for user root(uid=0) by core(uid=500) May 27 17:00:38.571908 systemd[1]: Starting audit-rules.service - Load Audit Rules... May 27 17:00:38.632416 augenrules[2121]: No rules May 27 17:00:38.635117 systemd[1]: audit-rules.service: Deactivated successfully. May 27 17:00:38.635614 systemd[1]: Finished audit-rules.service - Load Audit Rules. May 27 17:00:38.638592 sudo[2098]: pam_unix(sudo:session): session closed for user root May 27 17:00:38.662829 sshd[2097]: Connection closed by 139.178.68.195 port 37576 May 27 17:00:38.663562 sshd-session[2095]: pam_unix(sshd:session): session closed for user core May 27 17:00:38.671245 systemd[1]: sshd@5-172.31.23.127:22-139.178.68.195:37576.service: Deactivated successfully. May 27 17:00:38.674584 systemd[1]: session-6.scope: Deactivated successfully. May 27 17:00:38.677804 systemd-logind[1776]: Session 6 logged out. Waiting for processes to exit. May 27 17:00:38.680126 systemd-logind[1776]: Removed session 6. May 27 17:00:41.492681 systemd[1]: Started sshd@6-172.31.23.127:22-139.178.68.195:37592.service - OpenSSH per-connection server daemon (139.178.68.195:37592). May 27 17:00:41.684856 sshd[2130]: Accepted publickey for core from 139.178.68.195 port 37592 ssh2: RSA SHA256:zVfNVfC8v+Xfrinjy7jCJIf2+ESFz7qymQmXWOreRws May 27 17:00:41.687399 sshd-session[2130]: pam_unix(sshd:session): session opened for user core(uid=500) by core(uid=0) May 27 17:00:41.696887 systemd-logind[1776]: New session 7 of user core. May 27 17:00:41.707213 systemd[1]: Started session-7.scope - Session 7 of User core. May 27 17:00:41.815500 sudo[2137]: core : PWD=/tmp/tmp.DtjVkNCAXM ; USER=root ; COMMAND=/usr/sbin/ldd /usr/bin/nc /usr/bin/timeout May 27 17:00:41.816427 sudo[2137]: pam_unix(sudo:session): session opened for user root(uid=0) by core(uid=500) May 27 17:00:41.836215 sudo[2137]: pam_unix(sudo:session): session closed for user root May 27 17:00:41.846838 sudo[2149]: core : PWD=/tmp/tmp.DtjVkNCAXM ; USER=root ; COMMAND=/usr/sbin/rsync -av --relative --copy-links /usr/bin/nc /usr/bin/timeout /lib/ld-linux-aarch64.so.1 /lib64/ld-linux-aarch64.so.1 /lib64/libbsd.so.0 /lib64/libc.so.6 /lib64/libmd.so.0 /lib64/libresolv.so.2 ./ May 27 17:00:41.847631 sudo[2149]: pam_unix(sudo:session): session opened for user root(uid=0) by core(uid=500) May 27 17:00:41.921151 sudo[2149]: pam_unix(sudo:session): session closed for user root May 27 17:00:41.930666 sudo[2133]: core : PWD=/tmp/tmp.DtjVkNCAXM ; USER=root ; COMMAND=/usr/sbin/docker build -t netcat . May 27 17:00:41.931397 sudo[2133]: pam_unix(sudo:session): session opened for user root(uid=0) by core(uid=500) May 27 17:00:42.108417 systemd[1]: Starting docker.service - Docker Application Container Engine... May 27 17:00:42.123477 (dockerd)[2160]: 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 May 27 17:00:42.498073 dockerd[2160]: time="2025-05-27T17:00:42.497246057Z" level=info msg="Starting up" May 27 17:00:42.499935 dockerd[2160]: time="2025-05-27T17:00:42.499882085Z" level=info msg="OTEL tracing is not configured, using no-op tracer provider" May 27 17:00:42.563367 systemd[1]: var-lib-docker-metacopy\x2dcheck3558019606-merged.mount: Deactivated successfully. May 27 17:00:42.584618 dockerd[2160]: time="2025-05-27T17:00:42.584559881Z" level=info msg="Loading containers: start." May 27 17:00:42.599993 kernel: Initializing XFRM netlink socket May 27 17:00:42.914528 (udev-worker)[2182]: Network interface NamePolicy= disabled on kernel command line. May 27 17:00:42.990825 systemd-networkd[1737]: docker0: Link UP May 27 17:00:43.002632 dockerd[2160]: time="2025-05-27T17:00:43.002555355Z" level=info msg="Loading containers: done." May 27 17:00:43.035293 dockerd[2160]: time="2025-05-27T17:00:43.035098107Z" 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 May 27 17:00:43.035507 dockerd[2160]: time="2025-05-27T17:00:43.035408859Z" level=info msg="Docker daemon" commit=bbd0a17ccc67e48d4a69393287b7fcc4f0578683 containerd-snapshotter=false storage-driver=overlay2 version=28.0.1 May 27 17:00:43.035719 dockerd[2160]: time="2025-05-27T17:00:43.035670195Z" level=info msg="Initializing buildkit" May 27 17:00:43.086623 dockerd[2160]: time="2025-05-27T17:00:43.086555548Z" level=info msg="Completed buildkit initialization" May 27 17:00:43.099248 dockerd[2160]: time="2025-05-27T17:00:43.099033076Z" level=info msg="Daemon has completed initialization" May 27 17:00:43.099248 dockerd[2160]: time="2025-05-27T17:00:43.099131344Z" level=info msg="API listen on /run/docker.sock" May 27 17:00:43.100067 systemd[1]: Started docker.service - Docker Application Container Engine. May 27 17:00:43.539314 systemd[1]: var-lib-docker-overlay2-opaque\x2dbug\x2dcheck2462823280-merged.mount: Deactivated successfully. May 27 17:00:43.554494 dockerd[2160]: 2025/05/27 17:00:43 http2: server: error reading preface from client @: read unix /run/docker.sock->@: read: connection reset by peer May 27 17:00:44.003048 sudo[2133]: pam_unix(sudo:session): session closed for user root May 27 17:00:44.026001 sshd[2132]: Connection closed by 139.178.68.195 port 37592 May 27 17:00:44.026814 sshd-session[2130]: pam_unix(sshd:session): session closed for user core May 27 17:00:44.034256 systemd[1]: sshd@6-172.31.23.127:22-139.178.68.195:37592.service: Deactivated successfully. May 27 17:00:44.039325 systemd[1]: session-7.scope: Deactivated successfully. May 27 17:00:44.041046 systemd[1]: session-7.scope: Consumed 689ms CPU time, 134.4M memory peak. May 27 17:00:44.042247 systemd-logind[1776]: Session 7 logged out. Waiting for processes to exit. May 27 17:00:44.045372 systemd-logind[1776]: Removed session 7. May 27 17:00:48.547366 systemd[1]: Started sshd@7-172.31.23.127:22-139.178.68.195:55722.service - OpenSSH per-connection server daemon (139.178.68.195:55722). May 27 17:00:48.744664 sshd[2383]: Accepted publickey for core from 139.178.68.195 port 55722 ssh2: RSA SHA256:zVfNVfC8v+Xfrinjy7jCJIf2+ESFz7qymQmXWOreRws May 27 17:00:48.747284 sshd-session[2383]: pam_unix(sshd:session): session opened for user core(uid=500) by core(uid=0) May 27 17:00:48.755998 systemd-logind[1776]: New session 8 of user core. May 27 17:00:48.766283 systemd[1]: Started session-8.scope - Session 8 of User core. May 27 17:00:48.903985 systemd[1]: var-lib-docker-overlay2-c074f70cb6054d1ddb31d312286e8ed3080f713bd36eb00b33291c6c5836f42a\x2dinit-merged.mount: Deactivated successfully. May 27 17:00:48.962662 systemd[1]: var-lib-docker-overlay2-c074f70cb6054d1ddb31d312286e8ed3080f713bd36eb00b33291c6c5836f42a-merged.mount: Deactivated successfully. May 27 17:00:49.031745 containerd[1859]: time="2025-05-27T17:00:49.031684389Z" level=info msg="connecting to shim 614c4b2de81cae0969899018d4d0f50e16825bb03773f484fc6ac4f15c982da2" address="unix:///run/containerd/s/ae7e303cb2cbde4897ae6b0d5c4d727e69e110695829e9fdf97903d86cd667f2" namespace=moby protocol=ttrpc version=3 May 27 17:00:49.071228 systemd[1]: Started docker-614c4b2de81cae0969899018d4d0f50e16825bb03773f484fc6ac4f15c982da2.scope - libcontainer container 614c4b2de81cae0969899018d4d0f50e16825bb03773f484fc6ac4f15c982da2. May 27 17:00:49.139365 kernel: docker0: port 1(veth3847cd3) entered blocking state May 27 17:00:49.139485 kernel: docker0: port 1(veth3847cd3) entered disabled state May 27 17:00:49.139525 kernel: veth3847cd3: entered allmulticast mode May 27 17:00:49.141277 kernel: veth3847cd3: entered promiscuous mode May 27 17:00:49.143368 systemd-networkd[1737]: veth3847cd3: Link UP May 27 17:00:49.148754 (udev-worker)[2439]: Network interface NamePolicy= disabled on kernel command line. May 27 17:00:49.159011 kernel: eth0: renamed from veth88f9585 May 27 17:00:49.162627 kernel: docker0: port 1(veth3847cd3) entered blocking state May 27 17:00:49.162735 kernel: docker0: port 1(veth3847cd3) entered forwarding state May 27 17:00:49.162811 systemd-networkd[1737]: veth3847cd3: Gained carrier May 27 17:00:49.166129 systemd-networkd[1737]: docker0: Gained carrier May 27 17:00:49.213369 systemd[1]: docker-614c4b2de81cae0969899018d4d0f50e16825bb03773f484fc6ac4f15c982da2.scope: Deactivated successfully. May 27 17:00:49.241237 dockerd[2160]: time="2025-05-27T17:00:49.240988138Z" level=info msg="ignoring event" container=614c4b2de81cae0969899018d4d0f50e16825bb03773f484fc6ac4f15c982da2 module=libcontainerd namespace=moby topic=/tasks/delete type="*events.TaskDelete" May 27 17:00:49.242296 containerd[1859]: time="2025-05-27T17:00:49.242141686Z" level=info msg="shim disconnected" id=614c4b2de81cae0969899018d4d0f50e16825bb03773f484fc6ac4f15c982da2 namespace=moby May 27 17:00:49.242296 containerd[1859]: time="2025-05-27T17:00:49.242222698Z" level=warning msg="cleaning up after shim disconnected" id=614c4b2de81cae0969899018d4d0f50e16825bb03773f484fc6ac4f15c982da2 namespace=moby May 27 17:00:49.242642 containerd[1859]: time="2025-05-27T17:00:49.242274682Z" level=info msg="cleaning up dead shim" namespace=moby May 27 17:00:49.274348 systemd-networkd[1737]: veth3847cd3: Lost carrier May 27 17:00:49.274978 kernel: docker0: port 1(veth3847cd3) entered disabled state May 27 17:00:49.275046 kernel: veth88f9585: renamed from eth0 May 27 17:00:49.286924 (udev-worker)[2442]: Network interface NamePolicy= disabled on kernel command line. May 27 17:00:49.291109 systemd-networkd[1737]: veth3847cd3: Link DOWN May 27 17:00:49.293904 kernel: docker0: port 1(veth3847cd3) entered disabled state May 27 17:00:49.300113 kernel: veth3847cd3 (unregistering): left allmulticast mode May 27 17:00:49.300214 kernel: veth3847cd3 (unregistering): left promiscuous mode May 27 17:00:49.300281 kernel: docker0: port 1(veth3847cd3) entered disabled state May 27 17:00:49.354230 sshd[2385]: Connection closed by 139.178.68.195 port 55722 May 27 17:00:49.354112 sshd-session[2383]: pam_unix(sshd:session): session closed for user core May 27 17:00:49.360601 systemd[1]: sshd@7-172.31.23.127:22-139.178.68.195:55722.service: Deactivated successfully. May 27 17:00:49.365440 systemd[1]: session-8.scope: Deactivated successfully. May 27 17:00:49.367868 systemd-logind[1776]: Session 8 logged out. Waiting for processes to exit. May 27 17:00:49.370445 systemd-logind[1776]: Removed session 8. May 27 17:00:49.899400 systemd[1]: var-lib-docker-overlay2-c074f70cb6054d1ddb31d312286e8ed3080f713bd36eb00b33291c6c5836f42a-merged.mount: Deactivated successfully. May 27 17:00:50.197402 systemd-networkd[1737]: docker0: Lost carrier May 27 17:00:50.901217 systemd-networkd[1737]: docker0: Gained IPv6LL May 27 17:00:54.967268 systemd-resolved[1684]: Clock change detected. Flushing caches.