Nov 1 00:11:27.019053 kernel: Booting Linux on physical CPU 0x0000000000 [0x410fd083] Nov 1 00:11:27.019089 kernel: Linux version 5.15.192-flatcar (build@pony-truck.infra.kinvolk.io) (aarch64-cros-linux-gnu-gcc (Gentoo Hardened 11.3.1_p20221209 p3) 11.3.1 20221209, GNU ld (Gentoo 2.39 p5) 2.39.0) #1 SMP PREEMPT Fri Oct 31 23:12:38 -00 2025 Nov 1 00:11:27.019113 kernel: efi: EFI v2.70 by EDK II Nov 1 00:11:27.019128 kernel: efi: SMBIOS=0x7bed0000 SMBIOS 3.0=0x7beb0000 ACPI=0x786e0000 ACPI 2.0=0x786e0014 MEMATTR=0x7affea98 MEMRESERVE=0x716fcf98 Nov 1 00:11:27.019142 kernel: ACPI: Early table checksum verification disabled Nov 1 00:11:27.019156 kernel: ACPI: RSDP 0x00000000786E0014 000024 (v02 AMAZON) Nov 1 00:11:27.019172 kernel: ACPI: XSDT 0x00000000786D00E8 000064 (v01 AMAZON AMZNFACP 00000001 01000013) Nov 1 00:11:27.019187 kernel: ACPI: FACP 0x00000000786B0000 000114 (v06 AMAZON AMZNFACP 00000001 AMZN 00000001) Nov 1 00:11:27.019200 kernel: ACPI: DSDT 0x0000000078640000 00159D (v02 AMAZON AMZNDSDT 00000001 INTL 20160527) Nov 1 00:11:27.019214 kernel: ACPI: APIC 0x00000000786C0000 000108 (v04 AMAZON AMZNAPIC 00000001 AMZN 00000001) Nov 1 00:11:27.019233 kernel: ACPI: SPCR 0x00000000786A0000 000050 (v02 AMAZON AMZNSPCR 00000001 AMZN 00000001) Nov 1 00:11:27.019247 kernel: ACPI: GTDT 0x0000000078690000 000060 (v02 AMAZON AMZNGTDT 00000001 AMZN 00000001) Nov 1 00:11:27.019261 kernel: ACPI: MCFG 0x0000000078680000 00003C (v02 AMAZON AMZNMCFG 00000001 AMZN 00000001) Nov 1 00:11:27.019275 kernel: ACPI: SLIT 0x0000000078670000 00002D (v01 AMAZON AMZNSLIT 00000001 AMZN 00000001) Nov 1 00:11:27.019292 kernel: ACPI: IORT 0x0000000078660000 000078 (v01 AMAZON AMZNIORT 00000001 AMZN 00000001) Nov 1 00:11:27.019311 kernel: ACPI: PPTT 0x0000000078650000 0000EC (v01 AMAZON AMZNPPTT 00000001 AMZN 00000001) Nov 1 00:11:27.019325 kernel: ACPI: SPCR: console: uart,mmio,0x90a0000,115200 Nov 1 00:11:27.019340 kernel: earlycon: uart0 at MMIO 0x00000000090a0000 (options '115200') Nov 1 00:11:27.019355 kernel: printk: bootconsole [uart0] enabled Nov 1 00:11:27.019369 kernel: NUMA: Failed to initialise from firmware Nov 1 00:11:27.019384 kernel: NUMA: Faking a node at [mem 0x0000000040000000-0x00000004b5ffffff] Nov 1 00:11:27.019399 kernel: NUMA: NODE_DATA [mem 0x4b5843900-0x4b5848fff] Nov 1 00:11:27.019414 kernel: Zone ranges: Nov 1 00:11:27.019428 kernel: DMA [mem 0x0000000040000000-0x00000000ffffffff] Nov 1 00:11:27.019443 kernel: DMA32 empty Nov 1 00:11:27.019457 kernel: Normal [mem 0x0000000100000000-0x00000004b5ffffff] Nov 1 00:11:27.019476 kernel: Movable zone start for each node Nov 1 00:11:27.019490 kernel: Early memory node ranges Nov 1 00:11:27.019505 kernel: node 0: [mem 0x0000000040000000-0x000000007862ffff] Nov 1 00:11:27.019520 kernel: node 0: [mem 0x0000000078630000-0x000000007863ffff] Nov 1 00:11:27.019534 kernel: node 0: [mem 0x0000000078640000-0x00000000786effff] Nov 1 00:11:27.019549 kernel: node 0: [mem 0x00000000786f0000-0x000000007872ffff] Nov 1 00:11:27.019563 kernel: node 0: [mem 0x0000000078730000-0x000000007bbfffff] Nov 1 00:11:27.019578 kernel: node 0: [mem 0x000000007bc00000-0x000000007bfdffff] Nov 1 00:11:27.019592 kernel: node 0: [mem 0x000000007bfe0000-0x000000007fffffff] Nov 1 00:11:27.019607 kernel: node 0: [mem 0x0000000400000000-0x00000004b5ffffff] Nov 1 00:11:27.019622 kernel: Initmem setup node 0 [mem 0x0000000040000000-0x00000004b5ffffff] Nov 1 00:11:27.019636 kernel: On node 0, zone Normal: 8192 pages in unavailable ranges Nov 1 00:11:27.019655 kernel: psci: probing for conduit method from ACPI. Nov 1 00:11:27.019670 kernel: psci: PSCIv1.0 detected in firmware. Nov 1 00:11:27.019712 kernel: psci: Using standard PSCI v0.2 function IDs Nov 1 00:11:27.019730 kernel: psci: Trusted OS migration not required Nov 1 00:11:27.019746 kernel: psci: SMC Calling Convention v1.1 Nov 1 00:11:27.019766 kernel: smccc: KVM: hypervisor services detected (0x00000000 0x00000000 0x00000000 0x00000001) Nov 1 00:11:27.019782 kernel: ACPI: SRAT not present Nov 1 00:11:27.019798 kernel: percpu: Embedded 30 pages/cpu s83032 r8192 d31656 u122880 Nov 1 00:11:27.019813 kernel: pcpu-alloc: s83032 r8192 d31656 u122880 alloc=30*4096 Nov 1 00:11:27.019829 kernel: pcpu-alloc: [0] 0 [0] 1 Nov 1 00:11:27.019844 kernel: Detected PIPT I-cache on CPU0 Nov 1 00:11:27.019860 kernel: CPU features: detected: GIC system register CPU interface Nov 1 00:11:27.019875 kernel: CPU features: detected: Spectre-v2 Nov 1 00:11:27.019890 kernel: CPU features: detected: Spectre-v3a Nov 1 00:11:27.019905 kernel: CPU features: detected: Spectre-BHB Nov 1 00:11:27.019920 kernel: CPU features: kernel page table isolation forced ON by KASLR Nov 1 00:11:27.019940 kernel: CPU features: detected: Kernel page table isolation (KPTI) Nov 1 00:11:27.019955 kernel: CPU features: detected: ARM erratum 1742098 Nov 1 00:11:27.019974 kernel: CPU features: detected: ARM errata 1165522, 1319367, or 1530923 Nov 1 00:11:27.020000 kernel: Built 1 zonelists, mobility grouping on. Total pages: 991872 Nov 1 00:11:27.020019 kernel: Policy zone: Normal Nov 1 00:11:27.020037 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=284392058f112e827cd7c521dcce1be27e1367d0030df494642d12e41e342e29 Nov 1 00:11:27.020053 kernel: Unknown kernel command line parameters "BOOT_IMAGE=/flatcar/vmlinuz-a", will be passed to user space. Nov 1 00:11:27.020069 kernel: Dentry cache hash table entries: 524288 (order: 10, 4194304 bytes, linear) Nov 1 00:11:27.020084 kernel: Inode-cache hash table entries: 262144 (order: 9, 2097152 bytes, linear) Nov 1 00:11:27.020100 kernel: mem auto-init: stack:off, heap alloc:off, heap free:off Nov 1 00:11:27.020119 kernel: software IO TLB: mapped [mem 0x000000007c000000-0x0000000080000000] (64MB) Nov 1 00:11:27.020135 kernel: Memory: 3824460K/4030464K available (9792K kernel code, 2094K rwdata, 7592K rodata, 36416K init, 777K bss, 206004K reserved, 0K cma-reserved) Nov 1 00:11:27.020151 kernel: SLUB: HWalign=64, Order=0-3, MinObjects=0, CPUs=2, Nodes=1 Nov 1 00:11:27.020166 kernel: trace event string verifier disabled Nov 1 00:11:27.020181 kernel: rcu: Preemptible hierarchical RCU implementation. Nov 1 00:11:27.020198 kernel: rcu: RCU event tracing is enabled. Nov 1 00:11:27.020213 kernel: rcu: RCU restricting CPUs from NR_CPUS=512 to nr_cpu_ids=2. Nov 1 00:11:27.020229 kernel: Trampoline variant of Tasks RCU enabled. Nov 1 00:11:27.020245 kernel: Tracing variant of Tasks RCU enabled. Nov 1 00:11:27.020260 kernel: rcu: RCU calculated value of scheduler-enlistment delay is 100 jiffies. Nov 1 00:11:27.020276 kernel: rcu: Adjusting geometry for rcu_fanout_leaf=16, nr_cpu_ids=2 Nov 1 00:11:27.020291 kernel: NR_IRQS: 64, nr_irqs: 64, preallocated irqs: 0 Nov 1 00:11:27.020310 kernel: GICv3: 96 SPIs implemented Nov 1 00:11:27.020325 kernel: GICv3: 0 Extended SPIs implemented Nov 1 00:11:27.020340 kernel: GICv3: Distributor has no Range Selector support Nov 1 00:11:27.020356 kernel: Root IRQ handler: gic_handle_irq Nov 1 00:11:27.020371 kernel: GICv3: 16 PPIs implemented Nov 1 00:11:27.020387 kernel: GICv3: CPU0: found redistributor 0 region 0:0x0000000010200000 Nov 1 00:11:27.020402 kernel: ACPI: SRAT not present Nov 1 00:11:27.020417 kernel: ITS [mem 0x10080000-0x1009ffff] Nov 1 00:11:27.020433 kernel: ITS@0x0000000010080000: allocated 8192 Devices @400090000 (indirect, esz 8, psz 64K, shr 1) Nov 1 00:11:27.020448 kernel: ITS@0x0000000010080000: allocated 8192 Interrupt Collections @4000a0000 (flat, esz 8, psz 64K, shr 1) Nov 1 00:11:27.020464 kernel: GICv3: using LPI property table @0x00000004000b0000 Nov 1 00:11:27.020483 kernel: ITS: Using hypervisor restricted LPI range [128] Nov 1 00:11:27.020499 kernel: GICv3: CPU0: using allocated LPI pending table @0x00000004000d0000 Nov 1 00:11:27.020514 kernel: arch_timer: cp15 timer(s) running at 83.33MHz (virt). Nov 1 00:11:27.020530 kernel: clocksource: arch_sys_counter: mask: 0xffffffffffffff max_cycles: 0x13381ebeec, max_idle_ns: 440795203145 ns Nov 1 00:11:27.020545 kernel: sched_clock: 56 bits at 83MHz, resolution 12ns, wraps every 4398046511100ns Nov 1 00:11:27.020561 kernel: Console: colour dummy device 80x25 Nov 1 00:11:27.020578 kernel: printk: console [tty1] enabled Nov 1 00:11:27.020609 kernel: ACPI: Core revision 20210730 Nov 1 00:11:27.020628 kernel: Calibrating delay loop (skipped), value calculated using timer frequency.. 166.66 BogoMIPS (lpj=83333) Nov 1 00:11:27.020644 kernel: pid_max: default: 32768 minimum: 301 Nov 1 00:11:27.020665 kernel: LSM: Security Framework initializing Nov 1 00:11:27.023375 kernel: SELinux: Initializing. Nov 1 00:11:27.023399 kernel: Mount-cache hash table entries: 8192 (order: 4, 65536 bytes, linear) Nov 1 00:11:27.023416 kernel: Mountpoint-cache hash table entries: 8192 (order: 4, 65536 bytes, linear) Nov 1 00:11:27.023433 kernel: rcu: Hierarchical SRCU implementation. Nov 1 00:11:27.023449 kernel: Platform MSI: ITS@0x10080000 domain created Nov 1 00:11:27.023464 kernel: PCI/MSI: ITS@0x10080000 domain created Nov 1 00:11:27.023480 kernel: Remapping and enabling EFI services. Nov 1 00:11:27.023496 kernel: smp: Bringing up secondary CPUs ... Nov 1 00:11:27.023520 kernel: Detected PIPT I-cache on CPU1 Nov 1 00:11:27.023536 kernel: GICv3: CPU1: found redistributor 1 region 0:0x0000000010220000 Nov 1 00:11:27.023552 kernel: GICv3: CPU1: using allocated LPI pending table @0x00000004000e0000 Nov 1 00:11:27.023568 kernel: CPU1: Booted secondary processor 0x0000000001 [0x410fd083] Nov 1 00:11:27.023584 kernel: smp: Brought up 1 node, 2 CPUs Nov 1 00:11:27.023600 kernel: SMP: Total of 2 processors activated. Nov 1 00:11:27.023616 kernel: CPU features: detected: 32-bit EL0 Support Nov 1 00:11:27.023631 kernel: CPU features: detected: 32-bit EL1 Support Nov 1 00:11:27.023647 kernel: CPU features: detected: CRC32 instructions Nov 1 00:11:27.023667 kernel: CPU: All CPU(s) started at EL1 Nov 1 00:11:27.025931 kernel: alternatives: patching kernel code Nov 1 00:11:27.025958 kernel: devtmpfs: initialized Nov 1 00:11:27.025989 kernel: KASLR disabled due to lack of seed Nov 1 00:11:27.026011 kernel: clocksource: jiffies: mask: 0xffffffff max_cycles: 0xffffffff, max_idle_ns: 1911260446275000 ns Nov 1 00:11:27.026028 kernel: futex hash table entries: 512 (order: 3, 32768 bytes, linear) Nov 1 00:11:27.026045 kernel: pinctrl core: initialized pinctrl subsystem Nov 1 00:11:27.027838 kernel: SMBIOS 3.0.0 present. Nov 1 00:11:27.027856 kernel: DMI: Amazon EC2 a1.large/, BIOS 1.0 11/1/2018 Nov 1 00:11:27.027873 kernel: NET: Registered PF_NETLINK/PF_ROUTE protocol family Nov 1 00:11:27.027890 kernel: DMA: preallocated 512 KiB GFP_KERNEL pool for atomic allocations Nov 1 00:11:27.027907 kernel: DMA: preallocated 512 KiB GFP_KERNEL|GFP_DMA pool for atomic allocations Nov 1 00:11:27.027930 kernel: DMA: preallocated 512 KiB GFP_KERNEL|GFP_DMA32 pool for atomic allocations Nov 1 00:11:27.027947 kernel: audit: initializing netlink subsys (disabled) Nov 1 00:11:27.027964 kernel: audit: type=2000 audit(0.315:1): state=initialized audit_enabled=0 res=1 Nov 1 00:11:27.027980 kernel: thermal_sys: Registered thermal governor 'step_wise' Nov 1 00:11:27.027997 kernel: cpuidle: using governor menu Nov 1 00:11:27.028017 kernel: hw-breakpoint: found 6 breakpoint and 4 watchpoint registers. Nov 1 00:11:27.028034 kernel: ASID allocator initialised with 32768 entries Nov 1 00:11:27.028050 kernel: ACPI: bus type PCI registered Nov 1 00:11:27.028067 kernel: acpiphp: ACPI Hot Plug PCI Controller Driver version: 0.5 Nov 1 00:11:27.028083 kernel: Serial: AMBA PL011 UART driver Nov 1 00:11:27.028100 kernel: HugeTLB registered 1.00 GiB page size, pre-allocated 0 pages Nov 1 00:11:27.028117 kernel: HugeTLB registered 32.0 MiB page size, pre-allocated 0 pages Nov 1 00:11:27.028135 kernel: HugeTLB registered 2.00 MiB page size, pre-allocated 0 pages Nov 1 00:11:27.028151 kernel: HugeTLB registered 64.0 KiB page size, pre-allocated 0 pages Nov 1 00:11:27.028172 kernel: cryptd: max_cpu_qlen set to 1000 Nov 1 00:11:27.028188 kernel: alg: No test for fips(ansi_cprng) (fips_ansi_cprng) Nov 1 00:11:27.028205 kernel: ACPI: Added _OSI(Module Device) Nov 1 00:11:27.028221 kernel: ACPI: Added _OSI(Processor Device) Nov 1 00:11:27.028237 kernel: ACPI: Added _OSI(Processor Aggregator Device) Nov 1 00:11:27.028254 kernel: ACPI: Added _OSI(Linux-Dell-Video) Nov 1 00:11:27.028270 kernel: ACPI: Added _OSI(Linux-Lenovo-NV-HDMI-Audio) Nov 1 00:11:27.028287 kernel: ACPI: Added _OSI(Linux-HPI-Hybrid-Graphics) Nov 1 00:11:27.028303 kernel: ACPI: 1 ACPI AML tables successfully acquired and loaded Nov 1 00:11:27.028324 kernel: ACPI: Interpreter enabled Nov 1 00:11:27.028341 kernel: ACPI: Using GIC for interrupt routing Nov 1 00:11:27.028357 kernel: ACPI: MCFG table detected, 1 entries Nov 1 00:11:27.028374 kernel: ACPI: PCI Root Bridge [PCI0] (domain 0000 [bus 00-0f]) Nov 1 00:11:27.029240 kernel: acpi PNP0A08:00: _OSC: OS supports [ExtendedConfig ASPM ClockPM Segments MSI HPX-Type3] Nov 1 00:11:27.029477 kernel: acpi PNP0A08:00: _OSC: platform does not support [LTR] Nov 1 00:11:27.029723 kernel: acpi PNP0A08:00: _OSC: OS now controls [PCIeHotplug PME AER PCIeCapability] Nov 1 00:11:27.029951 kernel: acpi PNP0A08:00: ECAM area [mem 0x20000000-0x20ffffff] reserved by PNP0C02:00 Nov 1 00:11:27.030181 kernel: acpi PNP0A08:00: ECAM at [mem 0x20000000-0x20ffffff] for [bus 00-0f] Nov 1 00:11:27.030205 kernel: ACPI: Remapped I/O 0x000000001fff0000 to [io 0x0000-0xffff window] Nov 1 00:11:27.030222 kernel: acpiphp: Slot [1] registered Nov 1 00:11:27.030239 kernel: acpiphp: Slot [2] registered Nov 1 00:11:27.030255 kernel: acpiphp: Slot [3] registered Nov 1 00:11:27.030271 kernel: acpiphp: Slot [4] registered Nov 1 00:11:27.030288 kernel: acpiphp: Slot [5] registered Nov 1 00:11:27.030304 kernel: acpiphp: Slot [6] registered Nov 1 00:11:27.030320 kernel: acpiphp: Slot [7] registered Nov 1 00:11:27.030341 kernel: acpiphp: Slot [8] registered Nov 1 00:11:27.030357 kernel: acpiphp: Slot [9] registered Nov 1 00:11:27.030374 kernel: acpiphp: Slot [10] registered Nov 1 00:11:27.030390 kernel: acpiphp: Slot [11] registered Nov 1 00:11:27.030406 kernel: acpiphp: Slot [12] registered Nov 1 00:11:27.030423 kernel: acpiphp: Slot [13] registered Nov 1 00:11:27.030439 kernel: acpiphp: Slot [14] registered Nov 1 00:11:27.030455 kernel: acpiphp: Slot [15] registered Nov 1 00:11:27.030472 kernel: acpiphp: Slot [16] registered Nov 1 00:11:27.030492 kernel: acpiphp: Slot [17] registered Nov 1 00:11:27.030509 kernel: acpiphp: Slot [18] registered Nov 1 00:11:27.030525 kernel: acpiphp: Slot [19] registered Nov 1 00:11:27.030541 kernel: acpiphp: Slot [20] registered Nov 1 00:11:27.030557 kernel: acpiphp: Slot [21] registered Nov 1 00:11:27.030573 kernel: acpiphp: Slot [22] registered Nov 1 00:11:27.030590 kernel: acpiphp: Slot [23] registered Nov 1 00:11:27.030606 kernel: acpiphp: Slot [24] registered Nov 1 00:11:27.030622 kernel: acpiphp: Slot [25] registered Nov 1 00:11:27.030638 kernel: acpiphp: Slot [26] registered Nov 1 00:11:27.030658 kernel: acpiphp: Slot [27] registered Nov 1 00:11:27.030675 kernel: acpiphp: Slot [28] registered Nov 1 00:11:27.030711 kernel: acpiphp: Slot [29] registered Nov 1 00:11:27.030728 kernel: acpiphp: Slot [30] registered Nov 1 00:11:27.030745 kernel: acpiphp: Slot [31] registered Nov 1 00:11:27.030761 kernel: PCI host bridge to bus 0000:00 Nov 1 00:11:27.030985 kernel: pci_bus 0000:00: root bus resource [mem 0x80000000-0xffffffff window] Nov 1 00:11:27.031193 kernel: pci_bus 0000:00: root bus resource [io 0x0000-0xffff window] Nov 1 00:11:27.031402 kernel: pci_bus 0000:00: root bus resource [mem 0x400000000000-0x407fffffffff window] Nov 1 00:11:27.031615 kernel: pci_bus 0000:00: root bus resource [bus 00-0f] Nov 1 00:11:27.031887 kernel: pci 0000:00:00.0: [1d0f:0200] type 00 class 0x060000 Nov 1 00:11:27.032129 kernel: pci 0000:00:01.0: [1d0f:8250] type 00 class 0x070003 Nov 1 00:11:27.032359 kernel: pci 0000:00:01.0: reg 0x10: [mem 0x80118000-0x80118fff] Nov 1 00:11:27.032632 kernel: pci 0000:00:04.0: [1d0f:8061] type 00 class 0x010802 Nov 1 00:11:27.032912 kernel: pci 0000:00:04.0: reg 0x10: [mem 0x80114000-0x80117fff] Nov 1 00:11:27.033142 kernel: pci 0000:00:04.0: PME# supported from D0 D1 D2 D3hot D3cold Nov 1 00:11:27.033389 kernel: pci 0000:00:05.0: [1d0f:ec20] type 00 class 0x020000 Nov 1 00:11:27.033616 kernel: pci 0000:00:05.0: reg 0x10: [mem 0x80110000-0x80113fff] Nov 1 00:11:27.033880 kernel: pci 0000:00:05.0: reg 0x18: [mem 0x80000000-0x800fffff pref] Nov 1 00:11:27.034124 kernel: pci 0000:00:05.0: reg 0x20: [mem 0x80100000-0x8010ffff] Nov 1 00:11:27.034361 kernel: pci 0000:00:05.0: PME# supported from D0 D1 D2 D3hot D3cold Nov 1 00:11:27.034602 kernel: pci 0000:00:05.0: BAR 2: assigned [mem 0x80000000-0x800fffff pref] Nov 1 00:11:27.034864 kernel: pci 0000:00:05.0: BAR 4: assigned [mem 0x80100000-0x8010ffff] Nov 1 00:11:27.035097 kernel: pci 0000:00:04.0: BAR 0: assigned [mem 0x80110000-0x80113fff] Nov 1 00:11:27.035325 kernel: pci 0000:00:05.0: BAR 0: assigned [mem 0x80114000-0x80117fff] Nov 1 00:11:27.035560 kernel: pci 0000:00:01.0: BAR 0: assigned [mem 0x80118000-0x80118fff] Nov 1 00:11:27.035799 kernel: pci_bus 0000:00: resource 4 [mem 0x80000000-0xffffffff window] Nov 1 00:11:27.038981 kernel: pci_bus 0000:00: resource 5 [io 0x0000-0xffff window] Nov 1 00:11:27.039211 kernel: pci_bus 0000:00: resource 6 [mem 0x400000000000-0x407fffffffff window] Nov 1 00:11:27.039236 kernel: ACPI: PCI: Interrupt link GSI0 configured for IRQ 35 Nov 1 00:11:27.039254 kernel: ACPI: PCI: Interrupt link GSI1 configured for IRQ 36 Nov 1 00:11:27.039271 kernel: ACPI: PCI: Interrupt link GSI2 configured for IRQ 37 Nov 1 00:11:27.039288 kernel: ACPI: PCI: Interrupt link GSI3 configured for IRQ 38 Nov 1 00:11:27.039305 kernel: iommu: Default domain type: Translated Nov 1 00:11:27.039322 kernel: iommu: DMA domain TLB invalidation policy: strict mode Nov 1 00:11:27.039339 kernel: vgaarb: loaded Nov 1 00:11:27.039355 kernel: pps_core: LinuxPPS API ver. 1 registered Nov 1 00:11:27.039378 kernel: pps_core: Software ver. 5.3.6 - Copyright 2005-2007 Rodolfo Giometti Nov 1 00:11:27.039394 kernel: PTP clock support registered Nov 1 00:11:27.039411 kernel: Registered efivars operations Nov 1 00:11:27.039428 kernel: clocksource: Switched to clocksource arch_sys_counter Nov 1 00:11:27.039444 kernel: VFS: Disk quotas dquot_6.6.0 Nov 1 00:11:27.039461 kernel: VFS: Dquot-cache hash table entries: 512 (order 0, 4096 bytes) Nov 1 00:11:27.039477 kernel: pnp: PnP ACPI init Nov 1 00:11:27.039756 kernel: system 00:00: [mem 0x20000000-0x2fffffff] could not be reserved Nov 1 00:11:27.039790 kernel: pnp: PnP ACPI: found 1 devices Nov 1 00:11:27.039808 kernel: NET: Registered PF_INET protocol family Nov 1 00:11:27.039825 kernel: IP idents hash table entries: 65536 (order: 7, 524288 bytes, linear) Nov 1 00:11:27.039842 kernel: tcp_listen_portaddr_hash hash table entries: 2048 (order: 3, 32768 bytes, linear) Nov 1 00:11:27.039859 kernel: Table-perturb hash table entries: 65536 (order: 6, 262144 bytes, linear) Nov 1 00:11:27.039875 kernel: TCP established hash table entries: 32768 (order: 6, 262144 bytes, linear) Nov 1 00:11:27.039893 kernel: TCP bind hash table entries: 32768 (order: 7, 524288 bytes, linear) Nov 1 00:11:27.039909 kernel: TCP: Hash tables configured (established 32768 bind 32768) Nov 1 00:11:27.039926 kernel: UDP hash table entries: 2048 (order: 4, 65536 bytes, linear) Nov 1 00:11:27.039947 kernel: UDP-Lite hash table entries: 2048 (order: 4, 65536 bytes, linear) Nov 1 00:11:27.039964 kernel: NET: Registered PF_UNIX/PF_LOCAL protocol family Nov 1 00:11:27.039980 kernel: PCI: CLS 0 bytes, default 64 Nov 1 00:11:27.039997 kernel: hw perfevents: enabled with armv8_pmuv3_0 PMU driver, 3 counters available Nov 1 00:11:27.040013 kernel: kvm [1]: HYP mode not available Nov 1 00:11:27.040030 kernel: Initialise system trusted keyrings Nov 1 00:11:27.040047 kernel: workingset: timestamp_bits=39 max_order=20 bucket_order=0 Nov 1 00:11:27.040063 kernel: Key type asymmetric registered Nov 1 00:11:27.040079 kernel: Asymmetric key parser 'x509' registered Nov 1 00:11:27.040100 kernel: Block layer SCSI generic (bsg) driver version 0.4 loaded (major 249) Nov 1 00:11:27.040116 kernel: io scheduler mq-deadline registered Nov 1 00:11:27.040133 kernel: io scheduler kyber registered Nov 1 00:11:27.040149 kernel: io scheduler bfq registered Nov 1 00:11:27.040377 kernel: pl061_gpio ARMH0061:00: PL061 GPIO chip registered Nov 1 00:11:27.040404 kernel: input: Power Button as /devices/LNXSYSTM:00/LNXSYBUS:00/PNP0C0C:00/input/input0 Nov 1 00:11:27.040421 kernel: ACPI: button: Power Button [PWRB] Nov 1 00:11:27.040438 kernel: input: Sleep Button as /devices/LNXSYSTM:00/LNXSYBUS:00/PNP0C0E:00/input/input1 Nov 1 00:11:27.040459 kernel: ACPI: button: Sleep Button [SLPB] Nov 1 00:11:27.040476 kernel: Serial: 8250/16550 driver, 4 ports, IRQ sharing enabled Nov 1 00:11:27.040493 kernel: ACPI: \_SB_.PCI0.GSI2: Enabled at IRQ 37 Nov 1 00:11:27.040765 kernel: serial 0000:00:01.0: enabling device (0010 -> 0012) Nov 1 00:11:27.040790 kernel: printk: console [ttyS0] disabled Nov 1 00:11:27.040808 kernel: 0000:00:01.0: ttyS0 at MMIO 0x80118000 (irq = 14, base_baud = 115200) is a 16550A Nov 1 00:11:27.040824 kernel: printk: console [ttyS0] enabled Nov 1 00:11:27.040840 kernel: printk: bootconsole [uart0] disabled Nov 1 00:11:27.040857 kernel: thunder_xcv, ver 1.0 Nov 1 00:11:27.040878 kernel: thunder_bgx, ver 1.0 Nov 1 00:11:27.040895 kernel: nicpf, ver 1.0 Nov 1 00:11:27.040911 kernel: nicvf, ver 1.0 Nov 1 00:11:27.041145 kernel: rtc-efi rtc-efi.0: registered as rtc0 Nov 1 00:11:27.041368 kernel: rtc-efi rtc-efi.0: setting system clock to 2025-11-01T00:11:26 UTC (1761955886) Nov 1 00:11:27.041392 kernel: hid: raw HID events driver (C) Jiri Kosina Nov 1 00:11:27.041409 kernel: NET: Registered PF_INET6 protocol family Nov 1 00:11:27.041426 kernel: Segment Routing with IPv6 Nov 1 00:11:27.041442 kernel: In-situ OAM (IOAM) with IPv6 Nov 1 00:11:27.041464 kernel: NET: Registered PF_PACKET protocol family Nov 1 00:11:27.041480 kernel: Key type dns_resolver registered Nov 1 00:11:27.041496 kernel: registered taskstats version 1 Nov 1 00:11:27.041513 kernel: Loading compiled-in X.509 certificates Nov 1 00:11:27.041530 kernel: Loaded X.509 cert 'Kinvolk GmbH: Module signing key for 5.15.192-flatcar: 4aa5071b9a6f96878595e36d4bd5862a671c915d' Nov 1 00:11:27.041546 kernel: Key type .fscrypt registered Nov 1 00:11:27.041562 kernel: Key type fscrypt-provisioning registered Nov 1 00:11:27.041578 kernel: ima: No TPM chip found, activating TPM-bypass! Nov 1 00:11:27.041595 kernel: ima: Allocated hash algorithm: sha1 Nov 1 00:11:27.041616 kernel: ima: No architecture policies found Nov 1 00:11:27.041632 kernel: clk: Disabling unused clocks Nov 1 00:11:27.041649 kernel: Freeing unused kernel memory: 36416K Nov 1 00:11:27.041665 kernel: Run /init as init process Nov 1 00:11:27.041712 kernel: with arguments: Nov 1 00:11:27.041732 kernel: /init Nov 1 00:11:27.041748 kernel: with environment: Nov 1 00:11:27.041765 kernel: HOME=/ Nov 1 00:11:27.041781 kernel: TERM=linux Nov 1 00:11:27.041803 kernel: BOOT_IMAGE=/flatcar/vmlinuz-a Nov 1 00:11:27.041825 systemd[1]: systemd 252 running in system mode (+PAM +AUDIT +SELINUX -APPARMOR +IMA +SMACK +SECCOMP +GCRYPT -GNUTLS +OPENSSL -ACL +BLKID +CURL -ELFUTILS -FIDO2 +IDN2 -IDN +IPTC +KMOD +LIBCRYPTSETUP +LIBFDISK +PCRE2 -PWQUALITY -P11KIT -QRENCODE -TPM2 +BZIP2 +LZ4 +XZ +ZLIB +ZSTD -BPF_FRAMEWORK -XKBCOMMON +UTMP +SYSVINIT default-hierarchy=unified) Nov 1 00:11:27.041846 systemd[1]: Detected virtualization amazon. Nov 1 00:11:27.041865 systemd[1]: Detected architecture arm64. Nov 1 00:11:27.041882 systemd[1]: Running in initrd. Nov 1 00:11:27.041899 systemd[1]: No hostname configured, using default hostname. Nov 1 00:11:27.041916 systemd[1]: Hostname set to . Nov 1 00:11:27.041939 systemd[1]: Initializing machine ID from VM UUID. Nov 1 00:11:27.041957 systemd[1]: Queued start job for default target initrd.target. Nov 1 00:11:27.041975 systemd[1]: Started systemd-ask-password-console.path. Nov 1 00:11:27.041993 systemd[1]: Reached target cryptsetup.target. Nov 1 00:11:27.042010 systemd[1]: Reached target paths.target. Nov 1 00:11:27.042027 systemd[1]: Reached target slices.target. Nov 1 00:11:27.042045 systemd[1]: Reached target swap.target. Nov 1 00:11:27.042062 systemd[1]: Reached target timers.target. Nov 1 00:11:27.042085 systemd[1]: Listening on iscsid.socket. Nov 1 00:11:27.042102 systemd[1]: Listening on iscsiuio.socket. Nov 1 00:11:27.042120 systemd[1]: Listening on systemd-journald-audit.socket. Nov 1 00:11:27.042138 systemd[1]: Listening on systemd-journald-dev-log.socket. Nov 1 00:11:27.042156 systemd[1]: Listening on systemd-journald.socket. Nov 1 00:11:27.042173 systemd[1]: Listening on systemd-networkd.socket. Nov 1 00:11:27.042191 systemd[1]: Listening on systemd-udevd-control.socket. Nov 1 00:11:27.042208 systemd[1]: Listening on systemd-udevd-kernel.socket. Nov 1 00:11:27.042230 systemd[1]: Reached target sockets.target. Nov 1 00:11:27.042249 systemd[1]: Starting kmod-static-nodes.service... Nov 1 00:11:27.042266 systemd[1]: Finished network-cleanup.service. Nov 1 00:11:27.042284 systemd[1]: Starting systemd-fsck-usr.service... Nov 1 00:11:27.042301 systemd[1]: Starting systemd-journald.service... Nov 1 00:11:27.042319 systemd[1]: Starting systemd-modules-load.service... Nov 1 00:11:27.042336 systemd[1]: Starting systemd-resolved.service... Nov 1 00:11:27.042354 systemd[1]: Starting systemd-vconsole-setup.service... Nov 1 00:11:27.042371 systemd[1]: Finished kmod-static-nodes.service. Nov 1 00:11:27.042395 kernel: audit: type=1130 audit(1761955887.014:2): pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=kmod-static-nodes comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Nov 1 00:11:27.042414 systemd[1]: Finished systemd-fsck-usr.service. Nov 1 00:11:27.042432 kernel: audit: type=1130 audit(1761955887.026:3): pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=systemd-fsck-usr comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Nov 1 00:11:27.042452 systemd-journald[310]: Journal started Nov 1 00:11:27.042544 systemd-journald[310]: Runtime Journal (/run/log/journal/ec2758cd78cdbc8de39d57f5436c1109) is 8.0M, max 75.4M, 67.4M free. Nov 1 00:11:27.014000 audit[1]: SERVICE_START pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=kmod-static-nodes comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Nov 1 00:11:27.046396 systemd[1]: Finished systemd-vconsole-setup.service. Nov 1 00:11:27.026000 audit[1]: SERVICE_START pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=systemd-fsck-usr comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Nov 1 00:11:27.001786 systemd-modules-load[311]: Inserted module 'overlay' Nov 1 00:11:27.071829 systemd[1]: Started systemd-journald.service. Nov 1 00:11:27.071877 kernel: audit: type=1130 audit(1761955887.045:4): pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=systemd-vconsole-setup comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Nov 1 00:11:27.045000 audit[1]: SERVICE_START pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=systemd-vconsole-setup comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Nov 1 00:11:27.060422 systemd[1]: Starting dracut-cmdline-ask.service... Nov 1 00:11:27.086986 kernel: audit: type=1130 audit(1761955887.057:5): pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=systemd-journald comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Nov 1 00:11:27.057000 audit[1]: SERVICE_START pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=systemd-journald comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Nov 1 00:11:27.072848 systemd[1]: Starting systemd-tmpfiles-setup-dev.service... Nov 1 00:11:27.102991 systemd[1]: Finished systemd-tmpfiles-setup-dev.service. Nov 1 00:11:27.101000 audit[1]: SERVICE_START pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=systemd-tmpfiles-setup-dev comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Nov 1 00:11:27.116723 kernel: audit: type=1130 audit(1761955887.101:6): pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=systemd-tmpfiles-setup-dev comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Nov 1 00:11:27.121265 systemd[1]: Finished dracut-cmdline-ask.service. Nov 1 00:11:27.121000 audit[1]: SERVICE_START pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=dracut-cmdline-ask comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Nov 1 00:11:27.134414 systemd[1]: Starting dracut-cmdline.service... Nov 1 00:11:27.150184 kernel: audit: type=1130 audit(1761955887.121:7): pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=dracut-cmdline-ask comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Nov 1 00:11:27.150221 kernel: bridge: filtering via arp/ip/ip6tables is no longer available by default. Update your scripts to load br_netfilter if you need this. Nov 1 00:11:27.150858 systemd-resolved[312]: Positive Trust Anchors: Nov 1 00:11:27.152992 systemd-resolved[312]: . IN DS 20326 8 2 e06d44b80b8f1d39a95c0b0d7c65d08458e880409bbc683457104237c7f8ec8d Nov 1 00:11:27.156265 systemd-resolved[312]: 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 168.192.in-addr.arpa d.f.ip6.arpa corp home internal intranet lan local private test Nov 1 00:11:27.182418 kernel: Bridge firewalling registered Nov 1 00:11:27.178831 systemd-modules-load[311]: Inserted module 'br_netfilter' Nov 1 00:11:27.191483 dracut-cmdline[326]: dracut-dracut-053 Nov 1 00:11:27.203745 kernel: SCSI subsystem initialized Nov 1 00:11:27.208304 dracut-cmdline[326]: Using kernel command line parameters: rd.driver.pre=btrfs BOOT_IMAGE=/flatcar/vmlinuz-a mount.usr=/dev/mapper/usr verity.usr=PARTUUID=7130c94a-213a-4e5a-8e26-6cce9662f132 rootflags=rw mount.usrflags=ro consoleblank=0 root=LABEL=ROOT console=tty1 console=ttyS0,115200n8 earlycon flatcar.first_boot=detected acpi=force flatcar.oem.id=ec2 modprobe.blacklist=xen_fbfront net.ifnames=0 nvme_core.io_timeout=4294967295 verity.usrhash=284392058f112e827cd7c521dcce1be27e1367d0030df494642d12e41e342e29 Nov 1 00:11:27.238446 kernel: device-mapper: core: CONFIG_IMA_DISABLE_HTABLE is disabled. Duplicate IMA measurements will not be recorded in the IMA log. Nov 1 00:11:27.238521 kernel: device-mapper: uevent: version 1.0.3 Nov 1 00:11:27.240228 kernel: device-mapper: ioctl: 4.45.0-ioctl (2021-03-22) initialised: dm-devel@redhat.com Nov 1 00:11:27.250138 systemd-modules-load[311]: Inserted module 'dm_multipath' Nov 1 00:11:27.253358 systemd[1]: Finished systemd-modules-load.service. Nov 1 00:11:27.253000 audit[1]: SERVICE_START pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=systemd-modules-load comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Nov 1 00:11:27.264342 systemd[1]: Starting systemd-sysctl.service... Nov 1 00:11:27.274729 kernel: audit: type=1130 audit(1761955887.253:8): pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=systemd-modules-load comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Nov 1 00:11:27.291846 systemd[1]: Finished systemd-sysctl.service. Nov 1 00:11:27.292000 audit[1]: SERVICE_START pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=systemd-sysctl comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Nov 1 00:11:27.305721 kernel: audit: type=1130 audit(1761955887.292:9): pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=systemd-sysctl comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Nov 1 00:11:27.381710 kernel: Loading iSCSI transport class v2.0-870. Nov 1 00:11:27.400717 kernel: iscsi: registered transport (tcp) Nov 1 00:11:27.428769 kernel: iscsi: registered transport (qla4xxx) Nov 1 00:11:27.428839 kernel: QLogic iSCSI HBA Driver Nov 1 00:11:27.617533 systemd-resolved[312]: Defaulting to hostname 'linux'. Nov 1 00:11:27.620288 kernel: random: crng init done Nov 1 00:11:27.621433 systemd[1]: Started systemd-resolved.service. Nov 1 00:11:27.638308 kernel: audit: type=1130 audit(1761955887.621:10): pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=systemd-resolved comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Nov 1 00:11:27.621000 audit[1]: SERVICE_START pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=systemd-resolved comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Nov 1 00:11:27.623539 systemd[1]: Reached target nss-lookup.target. Nov 1 00:11:27.649195 systemd[1]: Finished dracut-cmdline.service. Nov 1 00:11:27.647000 audit[1]: SERVICE_START pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=dracut-cmdline comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Nov 1 00:11:27.650975 systemd[1]: Starting dracut-pre-udev.service... Nov 1 00:11:27.716736 kernel: raid6: neonx8 gen() 6417 MB/s Nov 1 00:11:27.734715 kernel: raid6: neonx8 xor() 4765 MB/s Nov 1 00:11:27.752715 kernel: raid6: neonx4 gen() 6559 MB/s Nov 1 00:11:27.770714 kernel: raid6: neonx4 xor() 4997 MB/s Nov 1 00:11:27.788717 kernel: raid6: neonx2 gen() 5765 MB/s Nov 1 00:11:27.806725 kernel: raid6: neonx2 xor() 4572 MB/s Nov 1 00:11:27.824726 kernel: raid6: neonx1 gen() 4494 MB/s Nov 1 00:11:27.842715 kernel: raid6: neonx1 xor() 3706 MB/s Nov 1 00:11:27.860714 kernel: raid6: int64x8 gen() 3445 MB/s Nov 1 00:11:27.878721 kernel: raid6: int64x8 xor() 2091 MB/s Nov 1 00:11:27.896715 kernel: raid6: int64x4 gen() 3839 MB/s Nov 1 00:11:27.914721 kernel: raid6: int64x4 xor() 2200 MB/s Nov 1 00:11:27.932733 kernel: raid6: int64x2 gen() 3596 MB/s Nov 1 00:11:27.950730 kernel: raid6: int64x2 xor() 1947 MB/s Nov 1 00:11:27.968719 kernel: raid6: int64x1 gen() 2765 MB/s Nov 1 00:11:27.988321 kernel: raid6: int64x1 xor() 1453 MB/s Nov 1 00:11:27.988354 kernel: raid6: using algorithm neonx4 gen() 6559 MB/s Nov 1 00:11:27.988389 kernel: raid6: .... xor() 4997 MB/s, rmw enabled Nov 1 00:11:27.990219 kernel: raid6: using neon recovery algorithm Nov 1 00:11:28.010885 kernel: xor: measuring software checksum speed Nov 1 00:11:28.010966 kernel: 8regs : 9291 MB/sec Nov 1 00:11:28.012825 kernel: 32regs : 11081 MB/sec Nov 1 00:11:28.014827 kernel: arm64_neon : 9546 MB/sec Nov 1 00:11:28.014877 kernel: xor: using function: 32regs (11081 MB/sec) Nov 1 00:11:28.113730 kernel: Btrfs loaded, crc32c=crc32c-generic, zoned=no, fsverity=no Nov 1 00:11:28.131728 systemd[1]: Finished dracut-pre-udev.service. Nov 1 00:11:28.132000 audit[1]: SERVICE_START pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=dracut-pre-udev comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Nov 1 00:11:28.139000 audit: BPF prog-id=7 op=LOAD Nov 1 00:11:28.139000 audit: BPF prog-id=8 op=LOAD Nov 1 00:11:28.141659 systemd[1]: Starting systemd-udevd.service... Nov 1 00:11:28.170992 systemd-udevd[508]: Using default interface naming scheme 'v252'. Nov 1 00:11:28.182481 systemd[1]: Started systemd-udevd.service. Nov 1 00:11:28.184000 audit[1]: SERVICE_START pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=systemd-udevd comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Nov 1 00:11:28.191606 systemd[1]: Starting dracut-pre-trigger.service... Nov 1 00:11:28.220216 dracut-pre-trigger[517]: rd.md=0: removing MD RAID activation Nov 1 00:11:28.280301 systemd[1]: Finished dracut-pre-trigger.service. Nov 1 00:11:28.278000 audit[1]: SERVICE_START pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=dracut-pre-trigger comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Nov 1 00:11:28.285291 systemd[1]: Starting systemd-udev-trigger.service... Nov 1 00:11:28.389394 systemd[1]: Finished systemd-udev-trigger.service. Nov 1 00:11:28.387000 audit[1]: SERVICE_START pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=systemd-udev-trigger comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Nov 1 00:11:28.519508 kernel: ACPI: \_SB_.PCI0.GSI1: Enabled at IRQ 36 Nov 1 00:11:28.519574 kernel: ena 0000:00:05.0: enabling device (0010 -> 0012) Nov 1 00:11:28.539196 kernel: ena 0000:00:05.0: ENA device version: 0.10 Nov 1 00:11:28.539446 kernel: ena 0000:00:05.0: ENA controller version: 0.0.1 implementation version 1 Nov 1 00:11:28.539803 kernel: ACPI: \_SB_.PCI0.GSI0: Enabled at IRQ 35 Nov 1 00:11:28.539830 kernel: nvme nvme0: pci function 0000:00:04.0 Nov 1 00:11:28.540127 kernel: ena 0000:00:05.0: Elastic Network Adapter (ENA) found at mem 80114000, mac addr 06:77:0e:6a:37:b5 Nov 1 00:11:28.543745 kernel: nvme nvme0: 2/0/0 default/read/poll queues Nov 1 00:11:28.551392 kernel: GPT:Primary header thinks Alt. header is not at the end of the disk. Nov 1 00:11:28.551456 kernel: GPT:9289727 != 33554431 Nov 1 00:11:28.551480 kernel: GPT:Alternate GPT header not at the end of the disk. Nov 1 00:11:28.553640 kernel: GPT:9289727 != 33554431 Nov 1 00:11:28.554994 kernel: GPT: Use GNU Parted to correct GPT errors. Nov 1 00:11:28.558473 kernel: nvme0n1: p1 p2 p3 p4 p6 p7 p9 Nov 1 00:11:28.562815 (udev-worker)[559]: Network interface NamePolicy= disabled on kernel command line. Nov 1 00:11:28.636713 kernel: BTRFS: device label OEM devid 1 transid 9 /dev/nvme0n1p6 scanned by (udev-worker) (558) Nov 1 00:11:28.724867 systemd[1]: Found device dev-disk-by\x2dlabel-EFI\x2dSYSTEM.device. Nov 1 00:11:28.753785 systemd[1]: Found device dev-disk-by\x2dlabel-OEM.device. Nov 1 00:11:28.766455 systemd[1]: Found device dev-disk-by\x2dpartuuid-7130c94a\x2d213a\x2d4e5a\x2d8e26\x2d6cce9662f132.device. Nov 1 00:11:28.771995 systemd[1]: Found device dev-disk-by\x2dpartlabel-USR\x2dA.device. Nov 1 00:11:28.786878 systemd[1]: Found device dev-disk-by\x2dlabel-ROOT.device. Nov 1 00:11:28.792851 systemd[1]: Starting disk-uuid.service... Nov 1 00:11:28.804287 disk-uuid[659]: Primary Header is updated. Nov 1 00:11:28.804287 disk-uuid[659]: Secondary Entries is updated. Nov 1 00:11:28.804287 disk-uuid[659]: Secondary Header is updated. Nov 1 00:11:28.814845 kernel: nvme0n1: p1 p2 p3 p4 p6 p7 p9 Nov 1 00:11:28.822729 kernel: nvme0n1: p1 p2 p3 p4 p6 p7 p9 Nov 1 00:11:28.828718 kernel: nvme0n1: p1 p2 p3 p4 p6 p7 p9 Nov 1 00:11:29.834757 kernel: nvme0n1: p1 p2 p3 p4 p6 p7 p9 Nov 1 00:11:29.837166 disk-uuid[660]: The operation has completed successfully. Nov 1 00:11:30.017717 systemd[1]: disk-uuid.service: Deactivated successfully. Nov 1 00:11:30.018282 systemd[1]: Finished disk-uuid.service. Nov 1 00:11:30.022000 audit[1]: SERVICE_START pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=disk-uuid comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Nov 1 00:11:30.022000 audit[1]: SERVICE_STOP pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=disk-uuid comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Nov 1 00:11:30.043255 systemd[1]: Starting verity-setup.service... Nov 1 00:11:30.073716 kernel: device-mapper: verity: sha256 using implementation "sha256-ce" Nov 1 00:11:30.181083 systemd[1]: Found device dev-mapper-usr.device. Nov 1 00:11:30.186214 systemd[1]: Mounting sysusr-usr.mount... Nov 1 00:11:30.194085 systemd[1]: Finished verity-setup.service. Nov 1 00:11:30.196000 audit[1]: SERVICE_START pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=verity-setup comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Nov 1 00:11:30.298748 kernel: EXT4-fs (dm-0): mounted filesystem without journal. Opts: norecovery. Quota mode: none. Nov 1 00:11:30.299387 systemd[1]: Mounted sysusr-usr.mount. Nov 1 00:11:30.299798 systemd[1]: afterburn-network-kargs.service was skipped because no trigger condition checks were met. Nov 1 00:11:30.301159 systemd[1]: Starting ignition-setup.service... Nov 1 00:11:30.312236 systemd[1]: Starting parse-ip-for-networkd.service... Nov 1 00:11:30.353529 kernel: BTRFS info (device nvme0n1p6): using crc32c (crc32c-generic) checksum algorithm Nov 1 00:11:30.353601 kernel: BTRFS info (device nvme0n1p6): using free space tree Nov 1 00:11:30.353627 kernel: BTRFS info (device nvme0n1p6): has skinny extents Nov 1 00:11:30.395736 kernel: BTRFS info (device nvme0n1p6): enabling ssd optimizations Nov 1 00:11:30.412604 systemd[1]: mnt-oem.mount: Deactivated successfully. Nov 1 00:11:30.428850 systemd[1]: Finished ignition-setup.service. Nov 1 00:11:30.429000 audit[1]: SERVICE_START pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=ignition-setup comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Nov 1 00:11:30.433825 systemd[1]: Starting ignition-fetch-offline.service... Nov 1 00:11:30.487961 systemd[1]: Finished parse-ip-for-networkd.service. Nov 1 00:11:30.486000 audit[1]: SERVICE_START pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=parse-ip-for-networkd comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Nov 1 00:11:30.495000 audit: BPF prog-id=9 op=LOAD Nov 1 00:11:30.497939 systemd[1]: Starting systemd-networkd.service... Nov 1 00:11:30.555209 systemd-networkd[1183]: lo: Link UP Nov 1 00:11:30.555231 systemd-networkd[1183]: lo: Gained carrier Nov 1 00:11:30.559733 systemd-networkd[1183]: Enumeration completed Nov 1 00:11:30.559908 systemd[1]: Started systemd-networkd.service. Nov 1 00:11:30.567968 systemd-networkd[1183]: eth0: Configuring with /usr/lib/systemd/network/zz-default.network. Nov 1 00:11:30.571000 audit[1]: SERVICE_START pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=systemd-networkd comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Nov 1 00:11:30.573603 systemd[1]: Reached target network.target. Nov 1 00:11:30.576471 systemd-networkd[1183]: eth0: Link UP Nov 1 00:11:30.576480 systemd-networkd[1183]: eth0: Gained carrier Nov 1 00:11:30.588453 systemd[1]: Starting iscsiuio.service... Nov 1 00:11:30.602068 systemd[1]: Started iscsiuio.service. Nov 1 00:11:30.600000 audit[1]: SERVICE_START pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=iscsiuio comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Nov 1 00:11:30.609020 systemd-networkd[1183]: eth0: DHCPv4 address 172.31.30.200/20, gateway 172.31.16.1 acquired from 172.31.16.1 Nov 1 00:11:30.609333 systemd[1]: Starting iscsid.service... Nov 1 00:11:30.626130 iscsid[1189]: iscsid: can't open InitiatorName configuration file /etc/iscsi/initiatorname.iscsi Nov 1 00:11:30.626130 iscsid[1189]: iscsid: Warning: InitiatorName file /etc/iscsi/initiatorname.iscsi does not exist or does not contain a properly formatted InitiatorName. If using software iscsi (iscsi_tcp or ib_iser) or partial offload (bnx2i or cxgbi iscsi), you may not be able to log into or discover targets. Please create a file /etc/iscsi/initiatorname.iscsi that contains a sting with the format: InitiatorName=iqn.yyyy-mm.[:identifier]. Nov 1 00:11:30.626130 iscsid[1189]: Example: InitiatorName=iqn.2001-04.com.redhat:fc6. Nov 1 00:11:30.626130 iscsid[1189]: If using hardware iscsi like qla4xxx this message can be ignored. Nov 1 00:11:30.626130 iscsid[1189]: iscsid: can't open InitiatorAlias configuration file /etc/iscsi/initiatorname.iscsi Nov 1 00:11:30.649593 iscsid[1189]: iscsid: can't open iscsid.safe_logout configuration file /etc/iscsi/iscsid.conf Nov 1 00:11:30.657552 systemd[1]: Started iscsid.service. Nov 1 00:11:30.675774 kernel: kauditd_printk_skb: 15 callbacks suppressed Nov 1 00:11:30.675821 kernel: audit: type=1130 audit(1761955890.655:26): pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=iscsid comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Nov 1 00:11:30.655000 audit[1]: SERVICE_START pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=iscsid comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Nov 1 00:11:30.665406 systemd[1]: Starting dracut-initqueue.service... Nov 1 00:11:30.695404 systemd[1]: Finished dracut-initqueue.service. Nov 1 00:11:30.699201 systemd[1]: Reached target remote-fs-pre.target. Nov 1 00:11:30.719889 kernel: audit: type=1130 audit(1761955890.697:27): pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=dracut-initqueue comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Nov 1 00:11:30.697000 audit[1]: SERVICE_START pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=dracut-initqueue comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Nov 1 00:11:30.701249 systemd[1]: Reached target remote-cryptsetup.target. Nov 1 00:11:30.710617 systemd[1]: Reached target remote-fs.target. Nov 1 00:11:30.713906 systemd[1]: Starting dracut-pre-mount.service... Nov 1 00:11:30.748837 kernel: audit: type=1130 audit(1761955890.736:28): pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=dracut-pre-mount comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Nov 1 00:11:30.736000 audit[1]: SERVICE_START pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=dracut-pre-mount comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Nov 1 00:11:30.733199 systemd[1]: Finished dracut-pre-mount.service. Nov 1 00:11:30.990423 ignition[1149]: Ignition 2.14.0 Nov 1 00:11:30.992311 ignition[1149]: Stage: fetch-offline Nov 1 00:11:30.994533 ignition[1149]: reading system config file "/usr/lib/ignition/base.d/base.ign" Nov 1 00:11:30.997198 ignition[1149]: parsing config with SHA512: 6629d8e825d60c9c9d4629d8547ef9a0b839d6b01b7f61a481a1f23308c924b8b0bbf10cae7f7fe3bcaf88b23d1a81baa7771c3670728d4d2a1e665216a1de7b Nov 1 00:11:31.017706 ignition[1149]: no config dir at "/usr/lib/ignition/base.platform.d/aws" Nov 1 00:11:31.020645 ignition[1149]: Ignition finished successfully Nov 1 00:11:31.022459 systemd[1]: Finished ignition-fetch-offline.service. Nov 1 00:11:31.026000 audit[1]: SERVICE_START pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=ignition-fetch-offline comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Nov 1 00:11:31.028835 systemd[1]: Starting ignition-fetch.service... Nov 1 00:11:31.041735 kernel: audit: type=1130 audit(1761955891.026:29): pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=ignition-fetch-offline comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Nov 1 00:11:31.053921 ignition[1208]: Ignition 2.14.0 Nov 1 00:11:31.053949 ignition[1208]: Stage: fetch Nov 1 00:11:31.054240 ignition[1208]: reading system config file "/usr/lib/ignition/base.d/base.ign" Nov 1 00:11:31.054304 ignition[1208]: parsing config with SHA512: 6629d8e825d60c9c9d4629d8547ef9a0b839d6b01b7f61a481a1f23308c924b8b0bbf10cae7f7fe3bcaf88b23d1a81baa7771c3670728d4d2a1e665216a1de7b Nov 1 00:11:31.070075 ignition[1208]: no config dir at "/usr/lib/ignition/base.platform.d/aws" Nov 1 00:11:31.072721 ignition[1208]: INFO : PUT http://169.254.169.254/latest/api/token: attempt #1 Nov 1 00:11:31.087606 ignition[1208]: INFO : PUT result: OK Nov 1 00:11:31.090888 ignition[1208]: DEBUG : parsed url from cmdline: "" Nov 1 00:11:31.090888 ignition[1208]: INFO : no config URL provided Nov 1 00:11:31.090888 ignition[1208]: INFO : reading system config file "/usr/lib/ignition/user.ign" Nov 1 00:11:31.090888 ignition[1208]: INFO : no config at "/usr/lib/ignition/user.ign" Nov 1 00:11:31.090888 ignition[1208]: INFO : PUT http://169.254.169.254/latest/api/token: attempt #1 Nov 1 00:11:31.102560 ignition[1208]: INFO : PUT result: OK Nov 1 00:11:31.102560 ignition[1208]: INFO : GET http://169.254.169.254/2019-10-01/user-data: attempt #1 Nov 1 00:11:31.102560 ignition[1208]: INFO : GET result: OK Nov 1 00:11:31.102560 ignition[1208]: DEBUG : parsing config with SHA512: 30a271d5e6b006a711402429278f3c2977dee9147660bed3c6c3d9fca2601445e88eb9c53860005a8c0b5bc250f4499d04761e0490565a83f9cb43cd551ee82f Nov 1 00:11:31.118769 unknown[1208]: fetched base config from "system" Nov 1 00:11:31.119017 unknown[1208]: fetched base config from "system" Nov 1 00:11:31.119706 ignition[1208]: fetch: fetch complete Nov 1 00:11:31.119032 unknown[1208]: fetched user config from "aws" Nov 1 00:11:31.119745 ignition[1208]: fetch: fetch passed Nov 1 00:11:31.119831 ignition[1208]: Ignition finished successfully Nov 1 00:11:31.132050 systemd[1]: Finished ignition-fetch.service. Nov 1 00:11:31.133000 audit[1]: SERVICE_START pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=ignition-fetch comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Nov 1 00:11:31.136996 systemd[1]: Starting ignition-kargs.service... Nov 1 00:11:31.149722 kernel: audit: type=1130 audit(1761955891.133:30): pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=ignition-fetch comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Nov 1 00:11:31.163530 ignition[1214]: Ignition 2.14.0 Nov 1 00:11:31.163558 ignition[1214]: Stage: kargs Nov 1 00:11:31.163931 ignition[1214]: reading system config file "/usr/lib/ignition/base.d/base.ign" Nov 1 00:11:31.163998 ignition[1214]: parsing config with SHA512: 6629d8e825d60c9c9d4629d8547ef9a0b839d6b01b7f61a481a1f23308c924b8b0bbf10cae7f7fe3bcaf88b23d1a81baa7771c3670728d4d2a1e665216a1de7b Nov 1 00:11:31.179179 ignition[1214]: no config dir at "/usr/lib/ignition/base.platform.d/aws" Nov 1 00:11:31.181912 ignition[1214]: INFO : PUT http://169.254.169.254/latest/api/token: attempt #1 Nov 1 00:11:31.185285 ignition[1214]: INFO : PUT result: OK Nov 1 00:11:31.195307 ignition[1214]: kargs: kargs passed Nov 1 00:11:31.195412 ignition[1214]: Ignition finished successfully Nov 1 00:11:31.199985 systemd[1]: Finished ignition-kargs.service. Nov 1 00:11:31.202000 audit[1]: SERVICE_START pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=ignition-kargs comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Nov 1 00:11:31.205145 systemd[1]: Starting ignition-disks.service... Nov 1 00:11:31.216464 kernel: audit: type=1130 audit(1761955891.202:31): pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=ignition-kargs comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Nov 1 00:11:31.222496 ignition[1220]: Ignition 2.14.0 Nov 1 00:11:31.222524 ignition[1220]: Stage: disks Nov 1 00:11:31.222858 ignition[1220]: reading system config file "/usr/lib/ignition/base.d/base.ign" Nov 1 00:11:31.222920 ignition[1220]: parsing config with SHA512: 6629d8e825d60c9c9d4629d8547ef9a0b839d6b01b7f61a481a1f23308c924b8b0bbf10cae7f7fe3bcaf88b23d1a81baa7771c3670728d4d2a1e665216a1de7b Nov 1 00:11:31.239096 ignition[1220]: no config dir at "/usr/lib/ignition/base.platform.d/aws" Nov 1 00:11:31.241841 ignition[1220]: INFO : PUT http://169.254.169.254/latest/api/token: attempt #1 Nov 1 00:11:31.245111 ignition[1220]: INFO : PUT result: OK Nov 1 00:11:31.249711 ignition[1220]: disks: disks passed Nov 1 00:11:31.249811 ignition[1220]: Ignition finished successfully Nov 1 00:11:31.270679 kernel: audit: type=1130 audit(1761955891.255:32): pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=ignition-disks comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Nov 1 00:11:31.255000 audit[1]: SERVICE_START pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=ignition-disks comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Nov 1 00:11:31.252411 systemd[1]: Finished ignition-disks.service. Nov 1 00:11:31.256886 systemd[1]: Reached target initrd-root-device.target. Nov 1 00:11:31.270770 systemd[1]: Reached target local-fs-pre.target. Nov 1 00:11:31.275844 systemd[1]: Reached target local-fs.target. Nov 1 00:11:31.279300 systemd[1]: Reached target sysinit.target. Nov 1 00:11:31.281082 systemd[1]: Reached target basic.target. Nov 1 00:11:31.286255 systemd[1]: Starting systemd-fsck-root.service... Nov 1 00:11:31.338804 systemd-fsck[1228]: ROOT: clean, 637/553520 files, 56031/553472 blocks Nov 1 00:11:31.345216 systemd[1]: Finished systemd-fsck-root.service. Nov 1 00:11:31.360267 kernel: audit: type=1130 audit(1761955891.348:33): pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=systemd-fsck-root comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Nov 1 00:11:31.348000 audit[1]: SERVICE_START pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=systemd-fsck-root comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Nov 1 00:11:31.350585 systemd[1]: Mounting sysroot.mount... Nov 1 00:11:31.377728 kernel: EXT4-fs (nvme0n1p9): mounted filesystem with ordered data mode. Opts: (null). Quota mode: none. Nov 1 00:11:31.379329 systemd[1]: Mounted sysroot.mount. Nov 1 00:11:31.379612 systemd[1]: Reached target initrd-root-fs.target. Nov 1 00:11:31.393018 systemd[1]: Mounting sysroot-usr.mount... Nov 1 00:11:31.397563 systemd[1]: flatcar-metadata-hostname.service was skipped because no trigger condition checks were met. Nov 1 00:11:31.397640 systemd[1]: ignition-remount-sysroot.service was skipped because of an unmet condition check (ConditionPathIsReadWrite=!/sysroot). Nov 1 00:11:31.397716 systemd[1]: Reached target ignition-diskful.target. Nov 1 00:11:31.401525 systemd[1]: Mounted sysroot-usr.mount. Nov 1 00:11:31.421511 systemd[1]: Mounting sysroot-usr-share-oem.mount... Nov 1 00:11:31.426661 systemd[1]: Starting initrd-setup-root.service... Nov 1 00:11:31.447503 initrd-setup-root[1250]: cut: /sysroot/etc/passwd: No such file or directory Nov 1 00:11:31.457754 kernel: BTRFS: device label OEM devid 1 transid 11 /dev/nvme0n1p6 scanned by mount (1245) Nov 1 00:11:31.464768 kernel: BTRFS info (device nvme0n1p6): using crc32c (crc32c-generic) checksum algorithm Nov 1 00:11:31.464809 kernel: BTRFS info (device nvme0n1p6): using free space tree Nov 1 00:11:31.464834 kernel: BTRFS info (device nvme0n1p6): has skinny extents Nov 1 00:11:31.469715 initrd-setup-root[1262]: cut: /sysroot/etc/group: No such file or directory Nov 1 00:11:31.479230 initrd-setup-root[1282]: cut: /sysroot/etc/shadow: No such file or directory Nov 1 00:11:31.489778 kernel: BTRFS info (device nvme0n1p6): enabling ssd optimizations Nov 1 00:11:31.493350 initrd-setup-root[1292]: cut: /sysroot/etc/gshadow: No such file or directory Nov 1 00:11:31.501595 systemd[1]: Mounted sysroot-usr-share-oem.mount. Nov 1 00:11:31.703024 systemd[1]: Finished initrd-setup-root.service. Nov 1 00:11:31.704000 audit[1]: SERVICE_START pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=initrd-setup-root comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Nov 1 00:11:31.715733 kernel: audit: type=1130 audit(1761955891.704:34): pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=initrd-setup-root comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Nov 1 00:11:31.716818 systemd[1]: Starting ignition-mount.service... Nov 1 00:11:31.719780 systemd[1]: Starting sysroot-boot.service... Nov 1 00:11:31.737059 systemd[1]: sysusr-usr-share-oem.mount: Deactivated successfully. Nov 1 00:11:31.737242 systemd[1]: sysroot-usr-share-oem.mount: Deactivated successfully. Nov 1 00:11:31.768503 ignition[1311]: INFO : Ignition 2.14.0 Nov 1 00:11:31.770583 ignition[1311]: INFO : Stage: mount Nov 1 00:11:31.770583 ignition[1311]: INFO : reading system config file "/usr/lib/ignition/base.d/base.ign" Nov 1 00:11:31.770583 ignition[1311]: DEBUG : parsing config with SHA512: 6629d8e825d60c9c9d4629d8547ef9a0b839d6b01b7f61a481a1f23308c924b8b0bbf10cae7f7fe3bcaf88b23d1a81baa7771c3670728d4d2a1e665216a1de7b Nov 1 00:11:31.786883 systemd[1]: Finished sysroot-boot.service. Nov 1 00:11:31.789000 audit[1]: SERVICE_START pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=sysroot-boot comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Nov 1 00:11:31.799713 kernel: audit: type=1130 audit(1761955891.789:35): pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=sysroot-boot comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Nov 1 00:11:31.800949 ignition[1311]: INFO : no config dir at "/usr/lib/ignition/base.platform.d/aws" Nov 1 00:11:31.803868 ignition[1311]: INFO : PUT http://169.254.169.254/latest/api/token: attempt #1 Nov 1 00:11:31.807426 ignition[1311]: INFO : PUT result: OK Nov 1 00:11:31.813930 ignition[1311]: INFO : mount: mount passed Nov 1 00:11:31.815887 ignition[1311]: INFO : Ignition finished successfully Nov 1 00:11:31.819436 systemd[1]: Finished ignition-mount.service. Nov 1 00:11:31.821000 audit[1]: SERVICE_START pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=ignition-mount comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Nov 1 00:11:31.824311 systemd[1]: Starting ignition-files.service... Nov 1 00:11:31.838818 systemd[1]: Mounting sysroot-usr-share-oem.mount... Nov 1 00:11:31.863721 kernel: BTRFS: device label OEM devid 1 transid 12 /dev/nvme0n1p6 scanned by mount (1320) Nov 1 00:11:31.869998 kernel: BTRFS info (device nvme0n1p6): using crc32c (crc32c-generic) checksum algorithm Nov 1 00:11:31.870035 kernel: BTRFS info (device nvme0n1p6): using free space tree Nov 1 00:11:31.872609 kernel: BTRFS info (device nvme0n1p6): has skinny extents Nov 1 00:11:31.913726 kernel: BTRFS info (device nvme0n1p6): enabling ssd optimizations Nov 1 00:11:31.919337 systemd[1]: Mounted sysroot-usr-share-oem.mount. Nov 1 00:11:31.937017 ignition[1339]: INFO : Ignition 2.14.0 Nov 1 00:11:31.937017 ignition[1339]: INFO : Stage: files Nov 1 00:11:31.944960 ignition[1339]: INFO : reading system config file "/usr/lib/ignition/base.d/base.ign" Nov 1 00:11:31.944960 ignition[1339]: DEBUG : parsing config with SHA512: 6629d8e825d60c9c9d4629d8547ef9a0b839d6b01b7f61a481a1f23308c924b8b0bbf10cae7f7fe3bcaf88b23d1a81baa7771c3670728d4d2a1e665216a1de7b Nov 1 00:11:31.972310 ignition[1339]: INFO : no config dir at "/usr/lib/ignition/base.platform.d/aws" Nov 1 00:11:31.976538 ignition[1339]: INFO : PUT http://169.254.169.254/latest/api/token: attempt #1 Nov 1 00:11:31.980786 ignition[1339]: INFO : PUT result: OK Nov 1 00:11:31.986464 ignition[1339]: DEBUG : files: compiled without relabeling support, skipping Nov 1 00:11:31.992876 ignition[1339]: INFO : files: ensureUsers: op(1): [started] creating or modifying user "core" Nov 1 00:11:31.996047 ignition[1339]: DEBUG : files: ensureUsers: op(1): executing: "usermod" "--root" "/sysroot" "core" Nov 1 00:11:32.027020 systemd-networkd[1183]: eth0: Gained IPv6LL Nov 1 00:11:32.049143 ignition[1339]: INFO : files: ensureUsers: op(1): [finished] creating or modifying user "core" Nov 1 00:11:32.052804 ignition[1339]: INFO : files: ensureUsers: op(2): [started] adding ssh keys to user "core" Nov 1 00:11:32.057814 unknown[1339]: wrote ssh authorized keys file for user: core Nov 1 00:11:32.060366 ignition[1339]: INFO : files: ensureUsers: op(2): [finished] adding ssh keys to user "core" Nov 1 00:11:32.065157 ignition[1339]: INFO : files: createFilesystemsFiles: createFiles: op(3): [started] writing file "/sysroot/etc/eks/bootstrap.sh" Nov 1 00:11:32.069465 ignition[1339]: INFO : oem config not found in "/usr/share/oem", looking on oem partition Nov 1 00:11:32.082877 ignition[1339]: INFO : op(1): [started] mounting "/dev/disk/by-label/OEM" at "/mnt/oem808085743" Nov 1 00:11:32.086317 ignition[1339]: CRITICAL : op(1): [failed] mounting "/dev/disk/by-label/OEM" at "/mnt/oem808085743": device or resource busy Nov 1 00:11:32.086317 ignition[1339]: ERROR : failed to mount ext4 device "/dev/disk/by-label/OEM" at "/mnt/oem808085743", trying btrfs: device or resource busy Nov 1 00:11:32.086317 ignition[1339]: INFO : op(2): [started] mounting "/dev/disk/by-label/OEM" at "/mnt/oem808085743" Nov 1 00:11:32.086317 ignition[1339]: INFO : op(2): [finished] mounting "/dev/disk/by-label/OEM" at "/mnt/oem808085743" Nov 1 00:11:32.100511 ignition[1339]: INFO : op(3): [started] unmounting "/mnt/oem808085743" Nov 1 00:11:32.100511 ignition[1339]: INFO : op(3): [finished] unmounting "/mnt/oem808085743" Nov 1 00:11:32.100511 ignition[1339]: INFO : files: createFilesystemsFiles: createFiles: op(3): [finished] writing file "/sysroot/etc/eks/bootstrap.sh" Nov 1 00:11:32.100511 ignition[1339]: INFO : files: createFilesystemsFiles: createFiles: op(4): [started] writing file "/sysroot/etc/flatcar/update.conf" Nov 1 00:11:32.100511 ignition[1339]: INFO : files: createFilesystemsFiles: createFiles: op(4): [finished] writing file "/sysroot/etc/flatcar/update.conf" Nov 1 00:11:32.100511 ignition[1339]: INFO : files: createFilesystemsFiles: createFiles: op(5): [started] writing file "/sysroot/etc/amazon/ssm/amazon-ssm-agent.json" Nov 1 00:11:32.100511 ignition[1339]: INFO : oem config not found in "/usr/share/oem", looking on oem partition Nov 1 00:11:32.131716 ignition[1339]: INFO : op(4): [started] mounting "/dev/disk/by-label/OEM" at "/mnt/oem3870258931" Nov 1 00:11:32.134977 ignition[1339]: CRITICAL : op(4): [failed] mounting "/dev/disk/by-label/OEM" at "/mnt/oem3870258931": device or resource busy Nov 1 00:11:32.134977 ignition[1339]: ERROR : failed to mount ext4 device "/dev/disk/by-label/OEM" at "/mnt/oem3870258931", trying btrfs: device or resource busy Nov 1 00:11:32.134977 ignition[1339]: INFO : op(5): [started] mounting "/dev/disk/by-label/OEM" at "/mnt/oem3870258931" Nov 1 00:11:32.134977 ignition[1339]: INFO : op(5): [finished] mounting "/dev/disk/by-label/OEM" at "/mnt/oem3870258931" Nov 1 00:11:32.134977 ignition[1339]: INFO : op(6): [started] unmounting "/mnt/oem3870258931" Nov 1 00:11:32.134977 ignition[1339]: INFO : op(6): [finished] unmounting "/mnt/oem3870258931" Nov 1 00:11:32.134977 ignition[1339]: INFO : files: createFilesystemsFiles: createFiles: op(5): [finished] writing file "/sysroot/etc/amazon/ssm/amazon-ssm-agent.json" Nov 1 00:11:32.161964 ignition[1339]: INFO : files: createFilesystemsFiles: createFiles: op(6): [started] writing file "/sysroot/etc/amazon/ssm/seelog.xml" Nov 1 00:11:32.161964 ignition[1339]: INFO : oem config not found in "/usr/share/oem", looking on oem partition Nov 1 00:11:32.177888 ignition[1339]: INFO : op(7): [started] mounting "/dev/disk/by-label/OEM" at "/mnt/oem1354565245" Nov 1 00:11:32.177888 ignition[1339]: CRITICAL : op(7): [failed] mounting "/dev/disk/by-label/OEM" at "/mnt/oem1354565245": device or resource busy Nov 1 00:11:32.177888 ignition[1339]: ERROR : failed to mount ext4 device "/dev/disk/by-label/OEM" at "/mnt/oem1354565245", trying btrfs: device or resource busy Nov 1 00:11:32.177888 ignition[1339]: INFO : op(8): [started] mounting "/dev/disk/by-label/OEM" at "/mnt/oem1354565245" Nov 1 00:11:32.193186 ignition[1339]: INFO : op(8): [finished] mounting "/dev/disk/by-label/OEM" at "/mnt/oem1354565245" Nov 1 00:11:32.193186 ignition[1339]: INFO : op(9): [started] unmounting "/mnt/oem1354565245" Nov 1 00:11:32.193186 ignition[1339]: INFO : op(9): [finished] unmounting "/mnt/oem1354565245" Nov 1 00:11:32.193186 ignition[1339]: INFO : files: createFilesystemsFiles: createFiles: op(6): [finished] writing file "/sysroot/etc/amazon/ssm/seelog.xml" Nov 1 00:11:32.193186 ignition[1339]: INFO : files: createFilesystemsFiles: createFiles: op(7): [started] writing file "/sysroot/etc/systemd/system/nvidia.service" Nov 1 00:11:32.193186 ignition[1339]: INFO : oem config not found in "/usr/share/oem", looking on oem partition Nov 1 00:11:32.223078 ignition[1339]: INFO : op(a): [started] mounting "/dev/disk/by-label/OEM" at "/mnt/oem950066184" Nov 1 00:11:32.223078 ignition[1339]: CRITICAL : op(a): [failed] mounting "/dev/disk/by-label/OEM" at "/mnt/oem950066184": device or resource busy Nov 1 00:11:32.223078 ignition[1339]: ERROR : failed to mount ext4 device "/dev/disk/by-label/OEM" at "/mnt/oem950066184", trying btrfs: device or resource busy Nov 1 00:11:32.223078 ignition[1339]: INFO : op(b): [started] mounting "/dev/disk/by-label/OEM" at "/mnt/oem950066184" Nov 1 00:11:32.238422 ignition[1339]: INFO : op(b): [finished] mounting "/dev/disk/by-label/OEM" at "/mnt/oem950066184" Nov 1 00:11:32.238422 ignition[1339]: INFO : op(c): [started] unmounting "/mnt/oem950066184" Nov 1 00:11:32.238422 ignition[1339]: INFO : op(c): [finished] unmounting "/mnt/oem950066184" Nov 1 00:11:32.238422 ignition[1339]: INFO : files: createFilesystemsFiles: createFiles: op(7): [finished] writing file "/sysroot/etc/systemd/system/nvidia.service" Nov 1 00:11:32.238422 ignition[1339]: INFO : files: op(8): [started] processing unit "coreos-metadata-sshkeys@.service" Nov 1 00:11:32.238422 ignition[1339]: INFO : files: op(8): [finished] processing unit "coreos-metadata-sshkeys@.service" Nov 1 00:11:32.238422 ignition[1339]: INFO : files: op(9): [started] processing unit "amazon-ssm-agent.service" Nov 1 00:11:32.238422 ignition[1339]: INFO : files: op(9): op(a): [started] writing unit "amazon-ssm-agent.service" at "/sysroot/etc/systemd/system/amazon-ssm-agent.service" Nov 1 00:11:32.238422 ignition[1339]: INFO : files: op(9): op(a): [finished] writing unit "amazon-ssm-agent.service" at "/sysroot/etc/systemd/system/amazon-ssm-agent.service" Nov 1 00:11:32.238422 ignition[1339]: INFO : files: op(9): [finished] processing unit "amazon-ssm-agent.service" Nov 1 00:11:32.238422 ignition[1339]: INFO : files: op(b): [started] processing unit "nvidia.service" Nov 1 00:11:32.238422 ignition[1339]: INFO : files: op(b): [finished] processing unit "nvidia.service" Nov 1 00:11:32.238422 ignition[1339]: INFO : files: op(c): [started] processing unit "etcd-member.service" Nov 1 00:11:32.238422 ignition[1339]: INFO : files: op(c): op(d): [started] writing systemd drop-in "20-clct-etcd-member.conf" at "/sysroot/etc/systemd/system/etcd-member.service.d/20-clct-etcd-member.conf" Nov 1 00:11:32.238422 ignition[1339]: INFO : files: op(c): op(d): [finished] writing systemd drop-in "20-clct-etcd-member.conf" at "/sysroot/etc/systemd/system/etcd-member.service.d/20-clct-etcd-member.conf" Nov 1 00:11:32.238422 ignition[1339]: INFO : files: op(c): [finished] processing unit "etcd-member.service" Nov 1 00:11:32.238422 ignition[1339]: INFO : files: op(e): [started] setting preset to enabled for "coreos-metadata-sshkeys@.service " Nov 1 00:11:32.238422 ignition[1339]: INFO : files: op(e): [finished] setting preset to enabled for "coreos-metadata-sshkeys@.service " Nov 1 00:11:32.238422 ignition[1339]: INFO : files: op(f): [started] setting preset to enabled for "amazon-ssm-agent.service" Nov 1 00:11:32.238422 ignition[1339]: INFO : files: op(f): [finished] setting preset to enabled for "amazon-ssm-agent.service" Nov 1 00:11:32.308730 ignition[1339]: INFO : files: op(10): [started] setting preset to enabled for "nvidia.service" Nov 1 00:11:32.308730 ignition[1339]: INFO : files: op(10): [finished] setting preset to enabled for "nvidia.service" Nov 1 00:11:32.308730 ignition[1339]: INFO : files: op(11): [started] setting preset to enabled for "etcd-member.service" Nov 1 00:11:32.308730 ignition[1339]: INFO : files: op(11): [finished] setting preset to enabled for "etcd-member.service" Nov 1 00:11:32.326726 ignition[1339]: INFO : files: createResultFile: createFiles: op(12): [started] writing file "/sysroot/etc/.ignition-result.json" Nov 1 00:11:32.326726 ignition[1339]: INFO : files: createResultFile: createFiles: op(12): [finished] writing file "/sysroot/etc/.ignition-result.json" Nov 1 00:11:32.326726 ignition[1339]: INFO : files: files passed Nov 1 00:11:32.326726 ignition[1339]: INFO : Ignition finished successfully Nov 1 00:11:32.334839 systemd[1]: Finished ignition-files.service. Nov 1 00:11:32.343000 audit[1]: SERVICE_START pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=ignition-files comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Nov 1 00:11:32.356523 systemd[1]: Starting initrd-setup-root-after-ignition.service... Nov 1 00:11:32.360603 systemd[1]: torcx-profile-populate.service was skipped because of an unmet condition check (ConditionPathExists=/sysroot/etc/torcx/next-profile). Nov 1 00:11:32.363310 systemd[1]: Starting ignition-quench.service... Nov 1 00:11:32.381253 systemd[1]: ignition-quench.service: Deactivated successfully. Nov 1 00:11:32.383873 systemd[1]: Finished ignition-quench.service. Nov 1 00:11:32.386000 audit[1]: SERVICE_START pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=ignition-quench comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Nov 1 00:11:32.386000 audit[1]: SERVICE_STOP pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=ignition-quench comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Nov 1 00:11:32.409487 initrd-setup-root-after-ignition[1364]: grep: /sysroot/etc/flatcar/enabled-sysext.conf: No such file or directory Nov 1 00:11:32.414371 systemd[1]: Finished initrd-setup-root-after-ignition.service. Nov 1 00:11:32.417000 audit[1]: SERVICE_START pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=initrd-setup-root-after-ignition comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Nov 1 00:11:32.419534 systemd[1]: Reached target ignition-complete.target. Nov 1 00:11:32.425356 systemd[1]: Starting initrd-parse-etc.service... Nov 1 00:11:32.456409 systemd[1]: initrd-parse-etc.service: Deactivated successfully. Nov 1 00:11:32.456665 systemd[1]: Finished initrd-parse-etc.service. Nov 1 00:11:32.462000 audit[1]: SERVICE_START pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=initrd-parse-etc comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Nov 1 00:11:32.462000 audit[1]: SERVICE_STOP pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=initrd-parse-etc comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Nov 1 00:11:32.464266 systemd[1]: Reached target initrd-fs.target. Nov 1 00:11:32.468834 systemd[1]: Reached target initrd.target. Nov 1 00:11:32.472363 systemd[1]: dracut-mount.service was skipped because no trigger condition checks were met. Nov 1 00:11:32.478592 systemd[1]: Starting dracut-pre-pivot.service... Nov 1 00:11:32.505270 systemd[1]: Finished dracut-pre-pivot.service. Nov 1 00:11:32.507000 audit[1]: SERVICE_START pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=dracut-pre-pivot comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Nov 1 00:11:32.511950 systemd[1]: Starting initrd-cleanup.service... Nov 1 00:11:32.534241 systemd[1]: Stopped target nss-lookup.target. Nov 1 00:11:32.538335 systemd[1]: Stopped target remote-cryptsetup.target. Nov 1 00:11:32.542803 systemd[1]: Stopped target timers.target. Nov 1 00:11:32.546572 systemd[1]: dracut-pre-pivot.service: Deactivated successfully. Nov 1 00:11:32.549132 systemd[1]: Stopped dracut-pre-pivot.service. Nov 1 00:11:32.551000 audit[1]: SERVICE_STOP pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=dracut-pre-pivot comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Nov 1 00:11:32.553439 systemd[1]: Stopped target initrd.target. Nov 1 00:11:32.557214 systemd[1]: Stopped target basic.target. Nov 1 00:11:32.560951 systemd[1]: Stopped target ignition-complete.target. Nov 1 00:11:32.565247 systemd[1]: Stopped target ignition-diskful.target. Nov 1 00:11:32.569485 systemd[1]: Stopped target initrd-root-device.target. Nov 1 00:11:32.573910 systemd[1]: Stopped target remote-fs.target. Nov 1 00:11:32.577807 systemd[1]: Stopped target remote-fs-pre.target. Nov 1 00:11:32.581926 systemd[1]: Stopped target sysinit.target. Nov 1 00:11:32.585796 systemd[1]: Stopped target local-fs.target. Nov 1 00:11:32.589673 systemd[1]: Stopped target local-fs-pre.target. Nov 1 00:11:32.593805 systemd[1]: Stopped target swap.target. Nov 1 00:11:32.597713 systemd[1]: dracut-pre-mount.service: Deactivated successfully. Nov 1 00:11:32.600321 systemd[1]: Stopped dracut-pre-mount.service. Nov 1 00:11:32.603000 audit[1]: SERVICE_STOP pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=dracut-pre-mount comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Nov 1 00:11:32.604588 systemd[1]: Stopped target cryptsetup.target. Nov 1 00:11:32.608139 systemd[1]: dracut-initqueue.service: Deactivated successfully. Nov 1 00:11:32.610456 systemd[1]: Stopped dracut-initqueue.service. Nov 1 00:11:32.612000 audit[1]: SERVICE_STOP pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=dracut-initqueue comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Nov 1 00:11:32.614257 systemd[1]: initrd-setup-root-after-ignition.service: Deactivated successfully. Nov 1 00:11:32.616925 systemd[1]: Stopped initrd-setup-root-after-ignition.service. Nov 1 00:11:32.620000 audit[1]: SERVICE_STOP pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=initrd-setup-root-after-ignition comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Nov 1 00:11:32.621756 systemd[1]: ignition-files.service: Deactivated successfully. Nov 1 00:11:32.624150 systemd[1]: Stopped ignition-files.service. Nov 1 00:11:32.626000 audit[1]: SERVICE_STOP pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=ignition-files comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Nov 1 00:11:32.629500 systemd[1]: Stopping ignition-mount.service... Nov 1 00:11:32.640000 audit[1]: SERVICE_STOP pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=kmod-static-nodes comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Nov 1 00:11:32.657788 ignition[1377]: INFO : Ignition 2.14.0 Nov 1 00:11:32.657788 ignition[1377]: INFO : Stage: umount Nov 1 00:11:32.657788 ignition[1377]: INFO : reading system config file "/usr/lib/ignition/base.d/base.ign" Nov 1 00:11:32.657788 ignition[1377]: DEBUG : parsing config with SHA512: 6629d8e825d60c9c9d4629d8547ef9a0b839d6b01b7f61a481a1f23308c924b8b0bbf10cae7f7fe3bcaf88b23d1a81baa7771c3670728d4d2a1e665216a1de7b Nov 1 00:11:32.670000 audit[1]: SERVICE_STOP pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=systemd-udev-trigger comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Nov 1 00:11:32.636959 systemd[1]: kmod-static-nodes.service: Deactivated successfully. Nov 1 00:11:32.685439 ignition[1377]: INFO : no config dir at "/usr/lib/ignition/base.platform.d/aws" Nov 1 00:11:32.685439 ignition[1377]: INFO : PUT http://169.254.169.254/latest/api/token: attempt #1 Nov 1 00:11:32.637282 systemd[1]: Stopped kmod-static-nodes.service. Nov 1 00:11:32.643712 systemd[1]: Stopping sysroot-boot.service... Nov 1 00:11:32.697000 audit[1]: SERVICE_STOP pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=dracut-pre-trigger comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Nov 1 00:11:32.657660 systemd[1]: systemd-udev-trigger.service: Deactivated successfully. Nov 1 00:11:32.658023 systemd[1]: Stopped systemd-udev-trigger.service. Nov 1 00:11:32.705571 ignition[1377]: INFO : PUT result: OK Nov 1 00:11:32.677273 systemd[1]: dracut-pre-trigger.service: Deactivated successfully. Nov 1 00:11:32.677526 systemd[1]: Stopped dracut-pre-trigger.service. Nov 1 00:11:32.716895 systemd[1]: initrd-cleanup.service: Deactivated successfully. Nov 1 00:11:32.718000 audit[1]: SERVICE_START pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=initrd-cleanup comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Nov 1 00:11:32.718000 audit[1]: SERVICE_STOP pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=initrd-cleanup comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Nov 1 00:11:32.723820 ignition[1377]: INFO : umount: umount passed Nov 1 00:11:32.723820 ignition[1377]: INFO : Ignition finished successfully Nov 1 00:11:32.717380 systemd[1]: Finished initrd-cleanup.service. Nov 1 00:11:32.730552 systemd[1]: ignition-mount.service: Deactivated successfully. Nov 1 00:11:32.736745 systemd[1]: Stopped ignition-mount.service. Nov 1 00:11:32.738000 audit[1]: SERVICE_STOP pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=ignition-mount comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Nov 1 00:11:32.740000 audit[1]: SERVICE_STOP pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=ignition-disks comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Nov 1 00:11:32.739800 systemd[1]: ignition-disks.service: Deactivated successfully. Nov 1 00:11:32.744000 audit[1]: SERVICE_STOP pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=ignition-kargs comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Nov 1 00:11:32.739911 systemd[1]: Stopped ignition-disks.service. Nov 1 00:11:32.755000 audit[1]: SERVICE_STOP pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=ignition-fetch comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Nov 1 00:11:32.742098 systemd[1]: ignition-kargs.service: Deactivated successfully. Nov 1 00:11:32.742286 systemd[1]: Stopped ignition-kargs.service. Nov 1 00:11:32.753046 systemd[1]: ignition-fetch.service: Deactivated successfully. Nov 1 00:11:32.766000 audit[1]: SERVICE_STOP pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=ignition-fetch-offline comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Nov 1 00:11:32.753157 systemd[1]: Stopped ignition-fetch.service. Nov 1 00:11:32.756723 systemd[1]: Stopped target network.target. Nov 1 00:11:32.758588 systemd[1]: ignition-fetch-offline.service: Deactivated successfully. Nov 1 00:11:32.760845 systemd[1]: Stopped ignition-fetch-offline.service. Nov 1 00:11:32.767221 systemd[1]: Stopped target paths.target. Nov 1 00:11:32.773156 systemd[1]: systemd-ask-password-console.path: Deactivated successfully. Nov 1 00:11:32.786223 systemd[1]: Stopped systemd-ask-password-console.path. Nov 1 00:11:32.794833 systemd[1]: Stopped target slices.target. Nov 1 00:11:32.798390 systemd[1]: Stopped target sockets.target. Nov 1 00:11:32.801859 systemd[1]: iscsid.socket: Deactivated successfully. Nov 1 00:11:32.802085 systemd[1]: Closed iscsid.socket. Nov 1 00:11:32.808991 systemd[1]: iscsiuio.socket: Deactivated successfully. Nov 1 00:11:32.810029 systemd[1]: Closed iscsiuio.socket. Nov 1 00:11:32.814633 systemd[1]: ignition-setup.service: Deactivated successfully. Nov 1 00:11:32.815356 systemd[1]: Stopped ignition-setup.service. Nov 1 00:11:32.818000 audit[1]: SERVICE_STOP pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=ignition-setup comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Nov 1 00:11:32.821154 systemd[1]: Stopping systemd-networkd.service... Nov 1 00:11:32.825257 systemd[1]: Stopping systemd-resolved.service... Nov 1 00:11:32.828044 systemd-networkd[1183]: eth0: DHCPv6 lease lost Nov 1 00:11:32.838194 systemd[1]: sysroot-boot.mount: Deactivated successfully. Nov 1 00:11:32.841644 systemd[1]: systemd-resolved.service: Deactivated successfully. Nov 1 00:11:32.844513 systemd[1]: Stopped systemd-resolved.service. Nov 1 00:11:32.846000 audit[1]: SERVICE_STOP pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=systemd-resolved comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Nov 1 00:11:32.849319 systemd[1]: systemd-networkd.service: Deactivated successfully. Nov 1 00:11:32.852000 audit[1]: SERVICE_STOP pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=systemd-networkd comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Nov 1 00:11:32.849537 systemd[1]: Stopped systemd-networkd.service. Nov 1 00:11:32.858251 systemd[1]: sysroot-boot.service: Deactivated successfully. Nov 1 00:11:32.860583 systemd[1]: Stopped sysroot-boot.service. Nov 1 00:11:32.862000 audit[1]: SERVICE_STOP pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=sysroot-boot comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Nov 1 00:11:32.862000 audit: BPF prog-id=6 op=UNLOAD Nov 1 00:11:32.862000 audit: BPF prog-id=9 op=UNLOAD Nov 1 00:11:32.864503 systemd[1]: systemd-networkd.socket: Deactivated successfully. Nov 1 00:11:32.864627 systemd[1]: Closed systemd-networkd.socket. Nov 1 00:11:32.870107 systemd[1]: initrd-setup-root.service: Deactivated successfully. Nov 1 00:11:32.870233 systemd[1]: Stopped initrd-setup-root.service. Nov 1 00:11:32.872000 audit[1]: SERVICE_STOP pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=initrd-setup-root comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Nov 1 00:11:32.877660 systemd[1]: Stopping network-cleanup.service... Nov 1 00:11:32.883000 audit[1]: SERVICE_STOP pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=parse-ip-for-networkd comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Nov 1 00:11:32.886000 audit[1]: SERVICE_STOP pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=systemd-sysctl comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Nov 1 00:11:32.881819 systemd[1]: parse-ip-for-networkd.service: Deactivated successfully. Nov 1 00:11:32.890000 audit[1]: SERVICE_STOP pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=systemd-modules-load comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Nov 1 00:11:32.883497 systemd[1]: Stopped parse-ip-for-networkd.service. Nov 1 00:11:32.885783 systemd[1]: systemd-sysctl.service: Deactivated successfully. Nov 1 00:11:32.885902 systemd[1]: Stopped systemd-sysctl.service. Nov 1 00:11:32.888188 systemd[1]: systemd-modules-load.service: Deactivated successfully. Nov 1 00:11:32.888293 systemd[1]: Stopped systemd-modules-load.service. Nov 1 00:11:32.899415 systemd[1]: Stopping systemd-udevd.service... Nov 1 00:11:32.914448 systemd[1]: run-credentials-systemd\x2dsysctl.service.mount: Deactivated successfully. Nov 1 00:11:32.918000 audit[1]: SERVICE_STOP pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=systemd-udevd comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Nov 1 00:11:32.915569 systemd[1]: systemd-udevd.service: Deactivated successfully. Nov 1 00:11:32.915913 systemd[1]: Stopped systemd-udevd.service. Nov 1 00:11:32.921989 systemd[1]: systemd-udevd-control.socket: Deactivated successfully. Nov 1 00:11:32.930000 audit[1]: SERVICE_STOP pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=dracut-pre-udev comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Nov 1 00:11:32.930000 audit[1]: SERVICE_STOP pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=dracut-cmdline comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Nov 1 00:11:32.931000 audit[1]: SERVICE_STOP pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=dracut-cmdline-ask comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Nov 1 00:11:32.933000 audit[1]: SERVICE_STOP pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=systemd-vconsole-setup comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Nov 1 00:11:32.922089 systemd[1]: Closed systemd-udevd-control.socket. Nov 1 00:11:32.928161 systemd[1]: systemd-udevd-kernel.socket: Deactivated successfully. Nov 1 00:11:32.943000 audit[1]: SERVICE_STOP pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=network-cleanup comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Nov 1 00:11:32.928269 systemd[1]: Closed systemd-udevd-kernel.socket. Nov 1 00:11:32.931448 systemd[1]: dracut-pre-udev.service: Deactivated successfully. Nov 1 00:11:32.960000 audit[1]: SERVICE_START pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=initrd-udevadm-cleanup-db comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Nov 1 00:11:32.960000 audit[1]: SERVICE_STOP pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=initrd-udevadm-cleanup-db comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Nov 1 00:11:32.931562 systemd[1]: Stopped dracut-pre-udev.service. Nov 1 00:11:32.932275 systemd[1]: dracut-cmdline.service: Deactivated successfully. Nov 1 00:11:32.932379 systemd[1]: Stopped dracut-cmdline.service. Nov 1 00:11:32.932609 systemd[1]: dracut-cmdline-ask.service: Deactivated successfully. Nov 1 00:11:32.932721 systemd[1]: Stopped dracut-cmdline-ask.service. Nov 1 00:11:32.934346 systemd[1]: Starting initrd-udevadm-cleanup-db.service... Nov 1 00:11:32.935185 systemd[1]: systemd-vconsole-setup.service: Deactivated successfully. Nov 1 00:11:32.935304 systemd[1]: Stopped systemd-vconsole-setup.service. Nov 1 00:11:32.937843 systemd[1]: network-cleanup.service: Deactivated successfully. Nov 1 00:11:32.942246 systemd[1]: Stopped network-cleanup.service. Nov 1 00:11:32.959325 systemd[1]: initrd-udevadm-cleanup-db.service: Deactivated successfully. Nov 1 00:11:32.959514 systemd[1]: Finished initrd-udevadm-cleanup-db.service. Nov 1 00:11:32.962407 systemd[1]: Reached target initrd-switch-root.target. Nov 1 00:11:32.963891 systemd[1]: Starting initrd-switch-root.service... Nov 1 00:11:33.005275 systemd[1]: Switching root. Nov 1 00:11:33.037249 iscsid[1189]: iscsid shutting down. Nov 1 00:11:33.038993 systemd-journald[310]: Received SIGTERM from PID 1 (n/a). Nov 1 00:11:33.039091 systemd-journald[310]: Journal stopped Nov 1 00:11:39.060155 kernel: SELinux: Class mctp_socket not defined in policy. Nov 1 00:11:39.060285 kernel: SELinux: Class anon_inode not defined in policy. Nov 1 00:11:39.060320 kernel: SELinux: the above unknown classes and permissions will be allowed Nov 1 00:11:39.060352 kernel: SELinux: policy capability network_peer_controls=1 Nov 1 00:11:39.060383 kernel: SELinux: policy capability open_perms=1 Nov 1 00:11:39.060421 kernel: SELinux: policy capability extended_socket_class=1 Nov 1 00:11:39.060453 kernel: SELinux: policy capability always_check_network=0 Nov 1 00:11:39.060482 kernel: SELinux: policy capability cgroup_seclabel=1 Nov 1 00:11:39.060530 kernel: SELinux: policy capability nnp_nosuid_transition=1 Nov 1 00:11:39.060567 kernel: SELinux: policy capability genfs_seclabel_symlinks=0 Nov 1 00:11:39.060598 kernel: SELinux: policy capability ioctl_skip_cloexec=0 Nov 1 00:11:39.060633 systemd[1]: Successfully loaded SELinux policy in 119.811ms. Nov 1 00:11:39.060711 systemd[1]: Relabelled /dev, /dev/shm, /run, /sys/fs/cgroup in 22.933ms. Nov 1 00:11:39.060747 systemd[1]: systemd 252 running in system mode (+PAM +AUDIT +SELINUX -APPARMOR +IMA +SMACK +SECCOMP +GCRYPT -GNUTLS +OPENSSL -ACL +BLKID +CURL -ELFUTILS -FIDO2 +IDN2 -IDN +IPTC +KMOD +LIBCRYPTSETUP +LIBFDISK +PCRE2 -PWQUALITY -P11KIT -QRENCODE -TPM2 +BZIP2 +LZ4 +XZ +ZLIB +ZSTD -BPF_FRAMEWORK -XKBCOMMON +UTMP +SYSVINIT default-hierarchy=unified) Nov 1 00:11:39.060783 systemd[1]: Detected virtualization amazon. Nov 1 00:11:39.060814 systemd[1]: Detected architecture arm64. Nov 1 00:11:39.060848 systemd[1]: Detected first boot. Nov 1 00:11:39.060882 systemd[1]: Initializing machine ID from VM UUID. Nov 1 00:11:39.060916 kernel: SELinux: Context system_u:object_r:container_file_t:s0:c1022,c1023 is not valid (left unmapped). Nov 1 00:11:39.060949 systemd[1]: Populated /etc with preset unit settings. Nov 1 00:11:39.060985 systemd[1]: /usr/lib/systemd/system/locksmithd.service:8: Unit uses CPUShares=; please use CPUWeight= instead. Support for CPUShares= will be removed soon. Nov 1 00:11:39.061024 systemd[1]: /usr/lib/systemd/system/locksmithd.service:9: Unit uses MemoryLimit=; please use MemoryMax= instead. Support for MemoryLimit= will be removed soon. Nov 1 00:11:39.061060 systemd[1]: /run/systemd/system/docker.socket:8: ListenStream= references a path below legacy directory /var/run/, updating /var/run/docker.sock → /run/docker.sock; please update the unit file accordingly. Nov 1 00:11:39.061094 kernel: kauditd_printk_skb: 57 callbacks suppressed Nov 1 00:11:39.061125 kernel: audit: type=1334 audit(1761955898.561:86): prog-id=12 op=LOAD Nov 1 00:11:39.061157 kernel: audit: type=1334 audit(1761955898.561:87): prog-id=3 op=UNLOAD Nov 1 00:11:39.061192 kernel: audit: type=1334 audit(1761955898.563:88): prog-id=13 op=LOAD Nov 1 00:11:39.061224 kernel: audit: type=1334 audit(1761955898.566:89): prog-id=14 op=LOAD Nov 1 00:11:39.061257 kernel: audit: type=1334 audit(1761955898.566:90): prog-id=4 op=UNLOAD Nov 1 00:11:39.061287 kernel: audit: type=1334 audit(1761955898.566:91): prog-id=5 op=UNLOAD Nov 1 00:11:39.061316 systemd[1]: iscsiuio.service: Deactivated successfully. Nov 1 00:11:39.061344 kernel: audit: type=1334 audit(1761955898.569:92): prog-id=15 op=LOAD Nov 1 00:11:39.061375 systemd[1]: Stopped iscsiuio.service. Nov 1 00:11:39.061405 kernel: audit: type=1334 audit(1761955898.569:93): prog-id=12 op=UNLOAD Nov 1 00:11:39.061444 kernel: audit: type=1334 audit(1761955898.571:94): prog-id=16 op=LOAD Nov 1 00:11:39.061474 kernel: audit: type=1334 audit(1761955898.574:95): prog-id=17 op=LOAD Nov 1 00:11:39.061506 systemd[1]: iscsid.service: Deactivated successfully. Nov 1 00:11:39.061540 systemd[1]: Stopped iscsid.service. Nov 1 00:11:39.061572 systemd[1]: initrd-switch-root.service: Deactivated successfully. Nov 1 00:11:39.061604 systemd[1]: Stopped initrd-switch-root.service. Nov 1 00:11:39.061635 systemd[1]: systemd-journald.service: Scheduled restart job, restart counter is at 1. Nov 1 00:11:39.061666 systemd[1]: Created slice system-addon\x2dconfig.slice. Nov 1 00:11:39.062713 systemd[1]: Created slice system-addon\x2drun.slice. Nov 1 00:11:39.062758 systemd[1]: Created slice system-coreos\x2dmetadata\x2dsshkeys.slice. Nov 1 00:11:39.062797 systemd[1]: Created slice system-getty.slice. Nov 1 00:11:39.062829 systemd[1]: Created slice system-modprobe.slice. Nov 1 00:11:39.062859 systemd[1]: Created slice system-serial\x2dgetty.slice. Nov 1 00:11:39.062890 systemd[1]: Created slice system-system\x2dcloudinit.slice. Nov 1 00:11:39.062920 systemd[1]: Created slice system-systemd\x2dfsck.slice. Nov 1 00:11:39.062953 systemd[1]: Created slice user.slice. Nov 1 00:11:39.062987 systemd[1]: Started systemd-ask-password-console.path. Nov 1 00:11:39.063020 systemd[1]: Started systemd-ask-password-wall.path. Nov 1 00:11:39.063049 systemd[1]: Set up automount boot.automount. Nov 1 00:11:39.063084 systemd[1]: Set up automount proc-sys-fs-binfmt_misc.automount. Nov 1 00:11:39.063118 systemd[1]: Stopped target initrd-switch-root.target. Nov 1 00:11:39.063151 systemd[1]: Stopped target initrd-fs.target. Nov 1 00:11:39.063181 systemd[1]: Stopped target initrd-root-fs.target. Nov 1 00:11:39.063214 systemd[1]: Reached target integritysetup.target. Nov 1 00:11:39.063245 systemd[1]: Reached target remote-cryptsetup.target. Nov 1 00:11:39.063279 systemd[1]: Reached target remote-fs.target. Nov 1 00:11:39.063310 systemd[1]: Reached target slices.target. Nov 1 00:11:39.063339 systemd[1]: Reached target swap.target. Nov 1 00:11:39.063368 systemd[1]: Reached target torcx.target. Nov 1 00:11:39.063404 systemd[1]: Reached target veritysetup.target. Nov 1 00:11:39.063434 systemd[1]: Listening on systemd-coredump.socket. Nov 1 00:11:39.063466 systemd[1]: Listening on systemd-initctl.socket. Nov 1 00:11:39.063498 systemd[1]: Listening on systemd-networkd.socket. Nov 1 00:11:39.063529 systemd[1]: Listening on systemd-udevd-control.socket. Nov 1 00:11:39.063559 systemd[1]: Listening on systemd-udevd-kernel.socket. Nov 1 00:11:39.063588 systemd[1]: Listening on systemd-userdbd.socket. Nov 1 00:11:39.063620 systemd[1]: Mounting dev-hugepages.mount... Nov 1 00:11:39.063652 systemd[1]: Mounting dev-mqueue.mount... Nov 1 00:11:39.063752 systemd[1]: Mounting media.mount... Nov 1 00:11:39.063786 systemd[1]: Mounting sys-kernel-debug.mount... Nov 1 00:11:39.063818 systemd[1]: Mounting sys-kernel-tracing.mount... Nov 1 00:11:39.063848 systemd[1]: Mounting tmp.mount... Nov 1 00:11:39.063878 systemd[1]: Starting flatcar-tmpfiles.service... Nov 1 00:11:39.063909 systemd[1]: ignition-delete-config.service was skipped because no trigger condition checks were met. Nov 1 00:11:39.063943 systemd[1]: Starting kmod-static-nodes.service... Nov 1 00:11:39.063975 systemd[1]: Starting modprobe@configfs.service... Nov 1 00:11:39.064008 systemd[1]: Starting modprobe@dm_mod.service... Nov 1 00:11:39.064044 systemd[1]: Starting modprobe@drm.service... Nov 1 00:11:39.064080 systemd[1]: Starting modprobe@efi_pstore.service... Nov 1 00:11:39.064110 systemd[1]: Starting modprobe@fuse.service... Nov 1 00:11:39.064142 systemd[1]: Starting modprobe@loop.service... Nov 1 00:11:39.064173 systemd[1]: setup-nsswitch.service was skipped because of an unmet condition check (ConditionPathExists=!/etc/nsswitch.conf). Nov 1 00:11:39.064202 systemd[1]: systemd-fsck-root.service: Deactivated successfully. Nov 1 00:11:39.064232 systemd[1]: Stopped systemd-fsck-root.service. Nov 1 00:11:39.064262 systemd[1]: systemd-fsck-usr.service: Deactivated successfully. Nov 1 00:11:39.064293 systemd[1]: Stopped systemd-fsck-usr.service. Nov 1 00:11:39.064326 systemd[1]: Stopped systemd-journald.service. Nov 1 00:11:39.064356 systemd[1]: Starting systemd-journald.service... Nov 1 00:11:39.064385 systemd[1]: Starting systemd-modules-load.service... Nov 1 00:11:39.064417 systemd[1]: Starting systemd-network-generator.service... Nov 1 00:11:39.064447 systemd[1]: Starting systemd-remount-fs.service... Nov 1 00:11:39.064477 systemd[1]: Starting systemd-udev-trigger.service... Nov 1 00:11:39.064508 systemd[1]: verity-setup.service: Deactivated successfully. Nov 1 00:11:39.079142 systemd[1]: Stopped verity-setup.service. Nov 1 00:11:39.079207 systemd[1]: Mounted dev-hugepages.mount. Nov 1 00:11:39.079250 systemd[1]: Mounted dev-mqueue.mount. Nov 1 00:11:39.079282 systemd[1]: Mounted media.mount. Nov 1 00:11:39.079313 systemd[1]: Mounted sys-kernel-debug.mount. Nov 1 00:11:39.079343 systemd[1]: Mounted sys-kernel-tracing.mount. Nov 1 00:11:39.079374 systemd[1]: Mounted tmp.mount. Nov 1 00:11:39.079404 systemd[1]: Finished kmod-static-nodes.service. Nov 1 00:11:39.079433 kernel: loop: module loaded Nov 1 00:11:39.079463 systemd[1]: modprobe@configfs.service: Deactivated successfully. Nov 1 00:11:39.079498 systemd[1]: Finished modprobe@configfs.service. Nov 1 00:11:39.079533 systemd[1]: modprobe@dm_mod.service: Deactivated successfully. Nov 1 00:11:39.079563 systemd[1]: Finished modprobe@dm_mod.service. Nov 1 00:11:39.079593 systemd[1]: modprobe@drm.service: Deactivated successfully. Nov 1 00:11:39.079626 systemd[1]: Finished modprobe@drm.service. Nov 1 00:11:39.079656 systemd[1]: modprobe@efi_pstore.service: Deactivated successfully. Nov 1 00:11:39.079711 systemd[1]: Finished modprobe@efi_pstore.service. Nov 1 00:11:39.079749 systemd[1]: modprobe@loop.service: Deactivated successfully. Nov 1 00:11:39.079780 systemd[1]: Finished modprobe@loop.service. Nov 1 00:11:39.079810 kernel: fuse: init (API version 7.34) Nov 1 00:11:39.079840 systemd[1]: Finished systemd-network-generator.service. Nov 1 00:11:39.079874 systemd[1]: modprobe@fuse.service: Deactivated successfully. Nov 1 00:11:39.079923 systemd[1]: Finished modprobe@fuse.service. Nov 1 00:11:39.079956 systemd[1]: Finished systemd-modules-load.service. Nov 1 00:11:39.079988 systemd[1]: Finished systemd-remount-fs.service. Nov 1 00:11:39.080019 systemd[1]: Reached target network-pre.target. Nov 1 00:11:39.080051 systemd[1]: Mounting sys-fs-fuse-connections.mount... Nov 1 00:11:39.080085 systemd-journald[1488]: Journal started Nov 1 00:11:39.080197 systemd-journald[1488]: Runtime Journal (/run/log/journal/ec2758cd78cdbc8de39d57f5436c1109) is 8.0M, max 75.4M, 67.4M free. Nov 1 00:11:33.779000 audit: MAC_POLICY_LOAD auid=4294967295 ses=4294967295 lsm=selinux res=1 Nov 1 00:11:33.984000 audit[1]: AVC avc: denied { bpf } for pid=1 comm="systemd" capability=39 scontext=system_u:system_r:kernel_t:s0 tcontext=system_u:system_r:kernel_t:s0 tclass=capability2 permissive=1 Nov 1 00:11:33.984000 audit[1]: AVC avc: denied { perfmon } for pid=1 comm="systemd" capability=38 scontext=system_u:system_r:kernel_t:s0 tcontext=system_u:system_r:kernel_t:s0 tclass=capability2 permissive=1 Nov 1 00:11:33.984000 audit: BPF prog-id=10 op=LOAD Nov 1 00:11:33.984000 audit: BPF prog-id=10 op=UNLOAD Nov 1 00:11:33.985000 audit: BPF prog-id=11 op=LOAD Nov 1 00:11:33.985000 audit: BPF prog-id=11 op=UNLOAD Nov 1 00:11:34.245000 audit[1410]: AVC avc: denied { associate } for pid=1410 comm="torcx-generator" name="docker" dev="tmpfs" ino=2 scontext=system_u:object_r:unlabeled_t:s0 tcontext=system_u:object_r:tmpfs_t:s0 tclass=filesystem permissive=1 srawcon="system_u:object_r:container_file_t:s0:c1022,c1023" Nov 1 00:11:34.245000 audit[1410]: SYSCALL arch=c00000b7 syscall=5 success=yes exit=0 a0=40000222fc a1=40000283d8 a2=40000268c0 a3=32 items=0 ppid=1393 pid=1410 auid=4294967295 uid=0 gid=0 euid=0 suid=0 fsuid=0 egid=0 sgid=0 fsgid=0 tty=(none) ses=4294967295 comm="torcx-generator" exe="/usr/lib/systemd/system-generators/torcx-generator" subj=system_u:system_r:kernel_t:s0 key=(null) Nov 1 00:11:34.245000 audit: PROCTITLE proctitle=2F7573722F6C69622F73797374656D642F73797374656D2D67656E657261746F72732F746F7263782D67656E657261746F72002F72756E2F73797374656D642F67656E657261746F72002F72756E2F73797374656D642F67656E657261746F722E6561726C79002F72756E2F73797374656D642F67656E657261746F722E6C61 Nov 1 00:11:34.250000 audit[1410]: AVC avc: denied { associate } for pid=1410 comm="torcx-generator" name="bin" scontext=system_u:object_r:unlabeled_t:s0 tcontext=system_u:object_r:tmpfs_t:s0 tclass=filesystem permissive=1 Nov 1 00:11:34.250000 audit[1410]: SYSCALL arch=c00000b7 syscall=34 success=yes exit=0 a0=ffffffffffffff9c a1=40000223d9 a2=1ed a3=0 items=2 ppid=1393 pid=1410 auid=4294967295 uid=0 gid=0 euid=0 suid=0 fsuid=0 egid=0 sgid=0 fsgid=0 tty=(none) ses=4294967295 comm="torcx-generator" exe="/usr/lib/systemd/system-generators/torcx-generator" subj=system_u:system_r:kernel_t:s0 key=(null) Nov 1 00:11:34.250000 audit: CWD cwd="/" Nov 1 00:11:34.250000 audit: PATH item=0 name=(null) inode=2 dev=00:1c mode=040755 ouid=0 ogid=0 rdev=00:00 obj=system_u:object_r:unlabeled_t:s0 nametype=PARENT cap_fp=0 cap_fi=0 cap_fe=0 cap_fver=0 cap_frootid=0 Nov 1 00:11:34.250000 audit: PATH item=1 name=(null) inode=3 dev=00:1c mode=040755 ouid=0 ogid=0 rdev=00:00 obj=system_u:object_r:unlabeled_t:s0 nametype=CREATE cap_fp=0 cap_fi=0 cap_fe=0 cap_fver=0 cap_frootid=0 Nov 1 00:11:34.250000 audit: PROCTITLE proctitle=2F7573722F6C69622F73797374656D642F73797374656D2D67656E657261746F72732F746F7263782D67656E657261746F72002F72756E2F73797374656D642F67656E657261746F72002F72756E2F73797374656D642F67656E657261746F722E6561726C79002F72756E2F73797374656D642F67656E657261746F722E6C61 Nov 1 00:11:38.561000 audit: BPF prog-id=12 op=LOAD Nov 1 00:11:38.561000 audit: BPF prog-id=3 op=UNLOAD Nov 1 00:11:38.563000 audit: BPF prog-id=13 op=LOAD Nov 1 00:11:38.566000 audit: BPF prog-id=14 op=LOAD Nov 1 00:11:38.566000 audit: BPF prog-id=4 op=UNLOAD Nov 1 00:11:38.566000 audit: BPF prog-id=5 op=UNLOAD Nov 1 00:11:38.569000 audit: BPF prog-id=15 op=LOAD Nov 1 00:11:38.569000 audit: BPF prog-id=12 op=UNLOAD Nov 1 00:11:38.571000 audit: BPF prog-id=16 op=LOAD Nov 1 00:11:38.574000 audit: BPF prog-id=17 op=LOAD Nov 1 00:11:38.574000 audit: BPF prog-id=13 op=UNLOAD Nov 1 00:11:38.574000 audit: BPF prog-id=14 op=UNLOAD Nov 1 00:11:38.576000 audit[1]: SERVICE_STOP pid=1 uid=0 auid=4294967295 ses=4294967295 subj=system_u:system_r:kernel_t:s0 msg='unit=systemd-journald comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Nov 1 00:11:38.587000 audit: BPF prog-id=15 op=UNLOAD Nov 1 00:11:38.596000 audit[1]: SERVICE_STOP pid=1 uid=0 auid=4294967295 ses=4294967295 subj=system_u:system_r:kernel_t:s0 msg='unit=iscsiuio comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Nov 1 00:11:38.603000 audit[1]: SERVICE_STOP pid=1 uid=0 auid=4294967295 ses=4294967295 subj=system_u:system_r:kernel_t:s0 msg='unit=iscsid comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Nov 1 00:11:38.611000 audit[1]: SERVICE_START pid=1 uid=0 auid=4294967295 ses=4294967295 subj=system_u:system_r:kernel_t:s0 msg='unit=initrd-switch-root comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Nov 1 00:11:38.611000 audit[1]: SERVICE_STOP pid=1 uid=0 auid=4294967295 ses=4294967295 subj=system_u:system_r:kernel_t:s0 msg='unit=initrd-switch-root comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Nov 1 00:11:38.876000 audit[1]: SERVICE_STOP pid=1 uid=0 auid=4294967295 ses=4294967295 subj=system_u:system_r:kernel_t:s0 msg='unit=systemd-fsck-root comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Nov 1 00:11:38.886000 audit[1]: SERVICE_STOP pid=1 uid=0 auid=4294967295 ses=4294967295 subj=system_u:system_r:kernel_t:s0 msg='unit=systemd-fsck-usr comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Nov 1 00:11:38.890000 audit[1]: SERVICE_START pid=1 uid=0 auid=4294967295 ses=4294967295 subj=system_u:system_r:kernel_t:s0 msg='unit=systemd-journald comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Nov 1 00:11:38.890000 audit[1]: SERVICE_STOP pid=1 uid=0 auid=4294967295 ses=4294967295 subj=system_u:system_r:kernel_t:s0 msg='unit=systemd-journald comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Nov 1 00:11:38.891000 audit: BPF prog-id=18 op=LOAD Nov 1 00:11:38.892000 audit: BPF prog-id=19 op=LOAD Nov 1 00:11:38.892000 audit: BPF prog-id=20 op=LOAD Nov 1 00:11:38.892000 audit: BPF prog-id=16 op=UNLOAD Nov 1 00:11:38.892000 audit: BPF prog-id=17 op=UNLOAD Nov 1 00:11:38.938000 audit[1]: SERVICE_STOP pid=1 uid=0 auid=4294967295 ses=4294967295 subj=system_u:system_r:kernel_t:s0 msg='unit=verity-setup comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Nov 1 00:11:38.978000 audit[1]: SERVICE_START pid=1 uid=0 auid=4294967295 ses=4294967295 subj=system_u:system_r:kernel_t:s0 msg='unit=kmod-static-nodes comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Nov 1 00:11:38.989000 audit[1]: SERVICE_START pid=1 uid=0 auid=4294967295 ses=4294967295 subj=system_u:system_r:kernel_t:s0 msg='unit=modprobe@configfs comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Nov 1 00:11:39.095801 systemd[1]: Mounting sys-kernel-config.mount... Nov 1 00:11:39.095877 systemd[1]: remount-root.service was skipped because of an unmet condition check (ConditionPathIsReadWrite=!/). Nov 1 00:11:38.989000 audit[1]: SERVICE_STOP pid=1 uid=0 auid=4294967295 ses=4294967295 subj=system_u:system_r:kernel_t:s0 msg='unit=modprobe@configfs comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Nov 1 00:11:39.105022 systemd[1]: Starting systemd-hwdb-update.service... Nov 1 00:11:38.998000 audit[1]: SERVICE_START pid=1 uid=0 auid=4294967295 ses=4294967295 subj=system_u:system_r:kernel_t:s0 msg='unit=modprobe@dm_mod comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Nov 1 00:11:38.998000 audit[1]: SERVICE_STOP pid=1 uid=0 auid=4294967295 ses=4294967295 subj=system_u:system_r:kernel_t:s0 msg='unit=modprobe@dm_mod comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Nov 1 00:11:39.007000 audit[1]: SERVICE_START pid=1 uid=0 auid=4294967295 ses=4294967295 subj=system_u:system_r:kernel_t:s0 msg='unit=modprobe@drm comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Nov 1 00:11:39.007000 audit[1]: SERVICE_STOP pid=1 uid=0 auid=4294967295 ses=4294967295 subj=system_u:system_r:kernel_t:s0 msg='unit=modprobe@drm comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Nov 1 00:11:39.015000 audit[1]: SERVICE_START pid=1 uid=0 auid=4294967295 ses=4294967295 subj=system_u:system_r:kernel_t:s0 msg='unit=modprobe@efi_pstore comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Nov 1 00:11:39.015000 audit[1]: SERVICE_STOP pid=1 uid=0 auid=4294967295 ses=4294967295 subj=system_u:system_r:kernel_t:s0 msg='unit=modprobe@efi_pstore comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Nov 1 00:11:39.026000 audit[1]: SERVICE_START pid=1 uid=0 auid=4294967295 ses=4294967295 subj=system_u:system_r:kernel_t:s0 msg='unit=modprobe@loop comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Nov 1 00:11:39.026000 audit[1]: SERVICE_STOP pid=1 uid=0 auid=4294967295 ses=4294967295 subj=system_u:system_r:kernel_t:s0 msg='unit=modprobe@loop comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Nov 1 00:11:39.035000 audit[1]: SERVICE_START pid=1 uid=0 auid=4294967295 ses=4294967295 subj=system_u:system_r:kernel_t:s0 msg='unit=systemd-network-generator comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Nov 1 00:11:39.114753 systemd[1]: systemd-pstore.service was skipped because of an unmet condition check (ConditionDirectoryNotEmpty=/sys/fs/pstore). Nov 1 00:11:39.045000 audit[1]: SERVICE_START pid=1 uid=0 auid=4294967295 ses=4294967295 subj=system_u:system_r:kernel_t:s0 msg='unit=modprobe@fuse comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Nov 1 00:11:39.045000 audit[1]: SERVICE_STOP pid=1 uid=0 auid=4294967295 ses=4294967295 subj=system_u:system_r:kernel_t:s0 msg='unit=modprobe@fuse comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Nov 1 00:11:39.052000 audit[1]: SERVICE_START pid=1 uid=0 auid=4294967295 ses=4294967295 subj=system_u:system_r:kernel_t:s0 msg='unit=systemd-modules-load comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Nov 1 00:11:39.052000 audit: CONFIG_CHANGE op=set audit_enabled=1 old=1 auid=4294967295 ses=4294967295 subj=system_u:system_r:kernel_t:s0 res=1 Nov 1 00:11:39.052000 audit[1488]: SYSCALL arch=c00000b7 syscall=211 success=yes exit=60 a0=5 a1=ffffe1976d70 a2=4000 a3=1 items=0 ppid=1 pid=1488 auid=4294967295 uid=0 gid=0 euid=0 suid=0 fsuid=0 egid=0 sgid=0 fsgid=0 tty=(none) ses=4294967295 comm="systemd-journal" exe="/usr/lib/systemd/systemd-journald" subj=system_u:system_r:kernel_t:s0 key=(null) Nov 1 00:11:39.052000 audit: PROCTITLE proctitle="/usr/lib/systemd/systemd-journald" Nov 1 00:11:39.065000 audit[1]: SERVICE_START pid=1 uid=0 auid=4294967295 ses=4294967295 subj=system_u:system_r:kernel_t:s0 msg='unit=systemd-remount-fs comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Nov 1 00:11:38.558175 systemd[1]: Queued start job for default target multi-user.target. Nov 1 00:11:39.134403 systemd[1]: Starting systemd-random-seed.service... Nov 1 00:11:39.134456 systemd[1]: systemd-repart.service was skipped because no trigger condition checks were met. Nov 1 00:11:39.134495 systemd[1]: Starting systemd-sysctl.service... Nov 1 00:11:34.232961 /usr/lib/systemd/system-generators/torcx-generator[1410]: time="2025-11-01T00:11:34Z" level=debug msg="common configuration parsed" base_dir=/var/lib/torcx/ conf_dir=/etc/torcx/ run_dir=/run/torcx/ store_paths="[/usr/share/torcx/store /usr/share/oem/torcx/store/3510.3.8 /usr/share/oem/torcx/store /var/lib/torcx/store/3510.3.8 /var/lib/torcx/store]" Nov 1 00:11:38.558196 systemd[1]: Unnecessary job was removed for dev-nvme0n1p6.device. Nov 1 00:11:34.234197 /usr/lib/systemd/system-generators/torcx-generator[1410]: time="2025-11-01T00:11:34Z" level=debug msg="profile found" name=docker-1.12-no path=/usr/share/torcx/profiles/docker-1.12-no.json Nov 1 00:11:38.577814 systemd[1]: systemd-journald.service: Deactivated successfully. Nov 1 00:11:34.234254 /usr/lib/systemd/system-generators/torcx-generator[1410]: time="2025-11-01T00:11:34Z" level=debug msg="profile found" name=vendor path=/usr/share/torcx/profiles/vendor.json Nov 1 00:11:34.234327 /usr/lib/systemd/system-generators/torcx-generator[1410]: time="2025-11-01T00:11:34Z" level=info msg="no vendor profile selected by /etc/flatcar/docker-1.12" Nov 1 00:11:39.143601 systemd[1]: Started systemd-journald.service. Nov 1 00:11:34.234354 /usr/lib/systemd/system-generators/torcx-generator[1410]: time="2025-11-01T00:11:34Z" level=debug msg="skipped missing lower profile" missing profile=oem Nov 1 00:11:34.234432 /usr/lib/systemd/system-generators/torcx-generator[1410]: time="2025-11-01T00:11:34Z" level=warning msg="no next profile: unable to read profile file: open /etc/torcx/next-profile: no such file or directory" Nov 1 00:11:34.234466 /usr/lib/systemd/system-generators/torcx-generator[1410]: time="2025-11-01T00:11:34Z" level=debug msg="apply configuration parsed" lower profiles (vendor/oem)="[vendor]" upper profile (user)= Nov 1 00:11:34.235065 /usr/lib/systemd/system-generators/torcx-generator[1410]: time="2025-11-01T00:11:34Z" level=debug msg="mounted tmpfs" target=/run/torcx/unpack Nov 1 00:11:34.235174 /usr/lib/systemd/system-generators/torcx-generator[1410]: time="2025-11-01T00:11:34Z" level=debug msg="profile found" name=docker-1.12-no path=/usr/share/torcx/profiles/docker-1.12-no.json Nov 1 00:11:39.143000 audit[1]: SERVICE_START pid=1 uid=0 auid=4294967295 ses=4294967295 subj=system_u:system_r:kernel_t:s0 msg='unit=systemd-journald comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Nov 1 00:11:34.235214 /usr/lib/systemd/system-generators/torcx-generator[1410]: time="2025-11-01T00:11:34Z" level=debug msg="profile found" name=vendor path=/usr/share/torcx/profiles/vendor.json Nov 1 00:11:39.145779 systemd[1]: Mounted sys-fs-fuse-connections.mount. Nov 1 00:11:34.236964 /usr/lib/systemd/system-generators/torcx-generator[1410]: time="2025-11-01T00:11:34Z" level=debug msg="new archive/reference added to cache" format=tgz name=docker path="/usr/share/torcx/store/docker:20.10.torcx.tgz" reference=20.10 Nov 1 00:11:39.153005 systemd[1]: Mounted sys-kernel-config.mount. Nov 1 00:11:34.237059 /usr/lib/systemd/system-generators/torcx-generator[1410]: time="2025-11-01T00:11:34Z" level=debug msg="new archive/reference added to cache" format=tgz name=docker path="/usr/share/torcx/store/docker:com.coreos.cl.torcx.tgz" reference=com.coreos.cl Nov 1 00:11:39.157323 systemd[1]: Starting systemd-journal-flush.service... Nov 1 00:11:34.237115 /usr/lib/systemd/system-generators/torcx-generator[1410]: time="2025-11-01T00:11:34Z" level=info msg="store skipped" err="open /usr/share/oem/torcx/store/3510.3.8: no such file or directory" path=/usr/share/oem/torcx/store/3510.3.8 Nov 1 00:11:34.237159 /usr/lib/systemd/system-generators/torcx-generator[1410]: time="2025-11-01T00:11:34Z" level=info msg="store skipped" err="open /usr/share/oem/torcx/store: no such file or directory" path=/usr/share/oem/torcx/store Nov 1 00:11:34.237210 /usr/lib/systemd/system-generators/torcx-generator[1410]: time="2025-11-01T00:11:34Z" level=info msg="store skipped" err="open /var/lib/torcx/store/3510.3.8: no such file or directory" path=/var/lib/torcx/store/3510.3.8 Nov 1 00:11:34.237249 /usr/lib/systemd/system-generators/torcx-generator[1410]: time="2025-11-01T00:11:34Z" level=info msg="store skipped" err="open /var/lib/torcx/store: no such file or directory" path=/var/lib/torcx/store Nov 1 00:11:37.639024 /usr/lib/systemd/system-generators/torcx-generator[1410]: time="2025-11-01T00:11:37Z" level=debug msg="image unpacked" image=docker path=/run/torcx/unpack/docker reference=com.coreos.cl Nov 1 00:11:37.639553 /usr/lib/systemd/system-generators/torcx-generator[1410]: time="2025-11-01T00:11:37Z" level=debug msg="binaries propagated" assets="[/bin/containerd /bin/containerd-shim /bin/ctr /bin/docker /bin/docker-containerd /bin/docker-containerd-shim /bin/docker-init /bin/docker-proxy /bin/docker-runc /bin/dockerd /bin/runc /bin/tini]" image=docker path=/run/torcx/unpack/docker reference=com.coreos.cl Nov 1 00:11:37.639825 /usr/lib/systemd/system-generators/torcx-generator[1410]: time="2025-11-01T00:11:37Z" level=debug msg="networkd units propagated" assets="[/lib/systemd/network/50-docker.network /lib/systemd/network/90-docker-veth.network]" image=docker path=/run/torcx/unpack/docker reference=com.coreos.cl Nov 1 00:11:37.640260 /usr/lib/systemd/system-generators/torcx-generator[1410]: time="2025-11-01T00:11:37Z" level=debug msg="systemd units propagated" assets="[/lib/systemd/system/containerd.service /lib/systemd/system/docker.service /lib/systemd/system/docker.socket /lib/systemd/system/sockets.target.wants /lib/systemd/system/multi-user.target.wants]" image=docker path=/run/torcx/unpack/docker reference=com.coreos.cl Nov 1 00:11:37.640368 /usr/lib/systemd/system-generators/torcx-generator[1410]: time="2025-11-01T00:11:37Z" level=debug msg="profile applied" sealed profile=/run/torcx/profile.json upper profile= Nov 1 00:11:37.640510 /usr/lib/systemd/system-generators/torcx-generator[1410]: time="2025-11-01T00:11:37Z" level=debug msg="system state sealed" content="[TORCX_LOWER_PROFILES=\"vendor\" TORCX_UPPER_PROFILE=\"\" TORCX_PROFILE_PATH=\"/run/torcx/profile.json\" TORCX_BINDIR=\"/run/torcx/bin\" TORCX_UNPACKDIR=\"/run/torcx/unpack\"]" path=/run/metadata/torcx Nov 1 00:11:39.184801 systemd[1]: Finished systemd-random-seed.service. Nov 1 00:11:39.185000 audit[1]: SERVICE_START pid=1 uid=0 auid=4294967295 ses=4294967295 subj=system_u:system_r:kernel_t:s0 msg='unit=systemd-random-seed comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Nov 1 00:11:39.187104 systemd[1]: Reached target first-boot-complete.target. Nov 1 00:11:39.192754 systemd-journald[1488]: Time spent on flushing to /var/log/journal/ec2758cd78cdbc8de39d57f5436c1109 is 51.466ms for 1116 entries. Nov 1 00:11:39.192754 systemd-journald[1488]: System Journal (/var/log/journal/ec2758cd78cdbc8de39d57f5436c1109) is 8.0M, max 195.6M, 187.6M free. Nov 1 00:11:39.291322 systemd-journald[1488]: Received client request to flush runtime journal. Nov 1 00:11:39.203000 audit[1]: SERVICE_START pid=1 uid=0 auid=4294967295 ses=4294967295 subj=system_u:system_r:kernel_t:s0 msg='unit=systemd-sysctl comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Nov 1 00:11:39.219000 audit[1]: SERVICE_START pid=1 uid=0 auid=4294967295 ses=4294967295 subj=system_u:system_r:kernel_t:s0 msg='unit=flatcar-tmpfiles comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Nov 1 00:11:39.202594 systemd[1]: Finished systemd-sysctl.service. Nov 1 00:11:39.216856 systemd[1]: Finished flatcar-tmpfiles.service. Nov 1 00:11:39.293000 audit[1]: SERVICE_START pid=1 uid=0 auid=4294967295 ses=4294967295 subj=system_u:system_r:kernel_t:s0 msg='unit=systemd-journal-flush comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Nov 1 00:11:39.223411 systemd[1]: Starting systemd-sysusers.service... Nov 1 00:11:39.292971 systemd[1]: Finished systemd-journal-flush.service. Nov 1 00:11:39.300416 systemd[1]: Finished systemd-udev-trigger.service. Nov 1 00:11:39.303000 audit[1]: SERVICE_START pid=1 uid=0 auid=4294967295 ses=4294967295 subj=system_u:system_r:kernel_t:s0 msg='unit=systemd-udev-trigger comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Nov 1 00:11:39.307054 systemd[1]: Starting systemd-udev-settle.service... Nov 1 00:11:39.323528 udevadm[1529]: systemd-udev-settle.service is deprecated. Please fix lvm2-activation-early.service, lvm2-activation.service not to pull it in. Nov 1 00:11:39.486061 systemd[1]: Finished systemd-sysusers.service. Nov 1 00:11:39.486000 audit[1]: SERVICE_START pid=1 uid=0 auid=4294967295 ses=4294967295 subj=system_u:system_r:kernel_t:s0 msg='unit=systemd-sysusers comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Nov 1 00:11:39.990412 systemd[1]: Finished systemd-hwdb-update.service. Nov 1 00:11:39.994000 audit[1]: SERVICE_START pid=1 uid=0 auid=4294967295 ses=4294967295 subj=system_u:system_r:kernel_t:s0 msg='unit=systemd-hwdb-update comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Nov 1 00:11:39.995000 audit: BPF prog-id=21 op=LOAD Nov 1 00:11:39.995000 audit: BPF prog-id=22 op=LOAD Nov 1 00:11:39.995000 audit: BPF prog-id=7 op=UNLOAD Nov 1 00:11:39.995000 audit: BPF prog-id=8 op=UNLOAD Nov 1 00:11:39.998577 systemd[1]: Starting systemd-udevd.service... Nov 1 00:11:40.034636 systemd-udevd[1530]: Using default interface naming scheme 'v252'. Nov 1 00:11:40.092785 systemd[1]: Started systemd-udevd.service. Nov 1 00:11:40.095000 audit[1]: SERVICE_START pid=1 uid=0 auid=4294967295 ses=4294967295 subj=system_u:system_r:kernel_t:s0 msg='unit=systemd-udevd comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Nov 1 00:11:40.096000 audit: BPF prog-id=23 op=LOAD Nov 1 00:11:40.099934 systemd[1]: Starting systemd-networkd.service... Nov 1 00:11:40.111000 audit: BPF prog-id=24 op=LOAD Nov 1 00:11:40.111000 audit: BPF prog-id=25 op=LOAD Nov 1 00:11:40.111000 audit: BPF prog-id=26 op=LOAD Nov 1 00:11:40.115457 systemd[1]: Starting systemd-userdbd.service... Nov 1 00:11:40.187467 systemd[1]: Started systemd-userdbd.service. Nov 1 00:11:40.191000 audit[1]: SERVICE_START pid=1 uid=0 auid=4294967295 ses=4294967295 subj=system_u:system_r:kernel_t:s0 msg='unit=systemd-userdbd comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Nov 1 00:11:40.202291 systemd[1]: Condition check resulted in dev-ttyS0.device being skipped. Nov 1 00:11:40.208541 (udev-worker)[1546]: Network interface NamePolicy= disabled on kernel command line. Nov 1 00:11:40.358965 systemd-networkd[1541]: lo: Link UP Nov 1 00:11:40.358995 systemd-networkd[1541]: lo: Gained carrier Nov 1 00:11:40.360010 systemd-networkd[1541]: Enumeration completed Nov 1 00:11:40.360187 systemd[1]: Started systemd-networkd.service. Nov 1 00:11:40.362000 audit[1]: SERVICE_START pid=1 uid=0 auid=4294967295 ses=4294967295 subj=system_u:system_r:kernel_t:s0 msg='unit=systemd-networkd comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Nov 1 00:11:40.366721 systemd[1]: Starting systemd-networkd-wait-online.service... Nov 1 00:11:40.374192 systemd-networkd[1541]: eth0: Configuring with /usr/lib/systemd/network/zz-default.network. Nov 1 00:11:40.380726 kernel: IPv6: ADDRCONF(NETDEV_CHANGE): eth0: link becomes ready Nov 1 00:11:40.380884 systemd-networkd[1541]: eth0: Link UP Nov 1 00:11:40.381240 systemd-networkd[1541]: eth0: Gained carrier Nov 1 00:11:40.392961 systemd-networkd[1541]: eth0: DHCPv4 address 172.31.30.200/20, gateway 172.31.16.1 acquired from 172.31.16.1 Nov 1 00:11:40.565071 systemd[1]: Found device dev-disk-by\x2dlabel-OEM.device. Nov 1 00:11:40.572425 systemd[1]: Finished systemd-udev-settle.service. Nov 1 00:11:40.573000 audit[1]: SERVICE_START pid=1 uid=0 auid=4294967295 ses=4294967295 subj=system_u:system_r:kernel_t:s0 msg='unit=systemd-udev-settle comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Nov 1 00:11:40.577282 systemd[1]: Starting lvm2-activation-early.service... Nov 1 00:11:40.621724 lvm[1649]: WARNING: Failed to connect to lvmetad. Falling back to device scanning. Nov 1 00:11:40.659311 systemd[1]: Finished lvm2-activation-early.service. Nov 1 00:11:40.661718 systemd[1]: Reached target cryptsetup.target. Nov 1 00:11:40.659000 audit[1]: SERVICE_START pid=1 uid=0 auid=4294967295 ses=4294967295 subj=system_u:system_r:kernel_t:s0 msg='unit=lvm2-activation-early comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Nov 1 00:11:40.665993 systemd[1]: Starting lvm2-activation.service... Nov 1 00:11:40.674941 lvm[1650]: WARNING: Failed to connect to lvmetad. Falling back to device scanning. Nov 1 00:11:40.712411 systemd[1]: Finished lvm2-activation.service. Nov 1 00:11:40.713000 audit[1]: SERVICE_START pid=1 uid=0 auid=4294967295 ses=4294967295 subj=system_u:system_r:kernel_t:s0 msg='unit=lvm2-activation comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Nov 1 00:11:40.714735 systemd[1]: Reached target local-fs-pre.target. Nov 1 00:11:40.716802 systemd[1]: var-lib-machines.mount was skipped because of an unmet condition check (ConditionPathExists=/var/lib/machines.raw). Nov 1 00:11:40.716860 systemd[1]: Reached target local-fs.target. Nov 1 00:11:40.718766 systemd[1]: Reached target machines.target. Nov 1 00:11:40.723038 systemd[1]: Starting ldconfig.service... Nov 1 00:11:40.726277 systemd[1]: systemd-binfmt.service was skipped because no trigger condition checks were met. Nov 1 00:11:40.726400 systemd[1]: systemd-boot-system-token.service was skipped because of an unmet condition check (ConditionPathExists=/sys/firmware/efi/efivars/LoaderFeatures-4a67b082-0a4c-41cf-b6c7-440b29bb8c4f). Nov 1 00:11:40.728749 systemd[1]: Starting systemd-boot-update.service... Nov 1 00:11:40.732612 systemd[1]: Starting systemd-fsck@dev-disk-by\x2dlabel-OEM.service... Nov 1 00:11:40.741944 systemd[1]: Starting systemd-machine-id-commit.service... Nov 1 00:11:40.744237 systemd[1]: systemd-sysext.service was skipped because no trigger condition checks were met. Nov 1 00:11:40.744370 systemd[1]: ensure-sysext.service was skipped because no trigger condition checks were met. Nov 1 00:11:40.746844 systemd[1]: Starting systemd-tmpfiles-setup.service... Nov 1 00:11:40.771747 systemd[1]: boot.automount: Got automount request for /boot, triggered by 1652 (bootctl) Nov 1 00:11:40.774067 systemd[1]: Starting systemd-fsck@dev-disk-by\x2dlabel-EFI\x2dSYSTEM.service... Nov 1 00:11:40.796633 systemd[1]: Finished systemd-fsck@dev-disk-by\x2dlabel-OEM.service. Nov 1 00:11:40.798000 audit[1]: SERVICE_START pid=1 uid=0 auid=4294967295 ses=4294967295 subj=system_u:system_r:kernel_t:s0 msg='unit=systemd-fsck@dev-disk-by\x2dlabel-OEM comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Nov 1 00:11:40.808541 systemd-tmpfiles[1655]: /usr/lib/tmpfiles.d/legacy.conf:13: Duplicate line for path "/run/lock", ignoring. Nov 1 00:11:40.848672 systemd[1]: etc-machine\x2did.mount: Deactivated successfully. Nov 1 00:11:40.849838 systemd[1]: Finished systemd-machine-id-commit.service. Nov 1 00:11:40.850000 audit[1]: SERVICE_START pid=1 uid=0 auid=4294967295 ses=4294967295 subj=system_u:system_r:kernel_t:s0 msg='unit=systemd-machine-id-commit comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Nov 1 00:11:40.855313 systemd-tmpfiles[1655]: /usr/lib/tmpfiles.d/provision.conf:20: Duplicate line for path "/root", ignoring. Nov 1 00:11:40.880129 systemd-tmpfiles[1655]: /usr/lib/tmpfiles.d/systemd.conf:29: Duplicate line for path "/var/lib/systemd", ignoring. Nov 1 00:11:40.901663 systemd-fsck[1660]: fsck.fat 4.2 (2021-01-31) Nov 1 00:11:40.901663 systemd-fsck[1660]: /dev/nvme0n1p1: 236 files, 117310/258078 clusters Nov 1 00:11:40.905181 systemd[1]: Finished systemd-fsck@dev-disk-by\x2dlabel-EFI\x2dSYSTEM.service. Nov 1 00:11:40.906000 audit[1]: SERVICE_START pid=1 uid=0 auid=4294967295 ses=4294967295 subj=system_u:system_r:kernel_t:s0 msg='unit=systemd-fsck@dev-disk-by\x2dlabel-EFI\x2dSYSTEM comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Nov 1 00:11:40.910217 systemd[1]: Mounting boot.mount... Nov 1 00:11:40.928874 systemd[1]: Mounted boot.mount. Nov 1 00:11:40.956354 systemd[1]: Finished systemd-boot-update.service. Nov 1 00:11:40.959000 audit[1]: SERVICE_START pid=1 uid=0 auid=4294967295 ses=4294967295 subj=system_u:system_r:kernel_t:s0 msg='unit=systemd-boot-update comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Nov 1 00:11:41.230503 systemd[1]: Finished systemd-tmpfiles-setup.service. Nov 1 00:11:41.231000 audit[1]: SERVICE_START pid=1 uid=0 auid=4294967295 ses=4294967295 subj=system_u:system_r:kernel_t:s0 msg='unit=systemd-tmpfiles-setup comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Nov 1 00:11:41.235561 systemd[1]: Starting audit-rules.service... Nov 1 00:11:41.239947 systemd[1]: Starting clean-ca-certificates.service... Nov 1 00:11:41.247472 systemd[1]: Starting systemd-journal-catalog-update.service... Nov 1 00:11:41.249000 audit: BPF prog-id=27 op=LOAD Nov 1 00:11:41.253284 systemd[1]: Starting systemd-resolved.service... Nov 1 00:11:41.257000 audit: BPF prog-id=28 op=LOAD Nov 1 00:11:41.261105 systemd[1]: Starting systemd-timesyncd.service... Nov 1 00:11:41.265972 systemd[1]: Starting systemd-update-utmp.service... Nov 1 00:11:41.285000 audit[1680]: SYSTEM_BOOT pid=1680 uid=0 auid=4294967295 ses=4294967295 subj=system_u:system_r:kernel_t:s0 msg=' comm="systemd-update-utmp" exe="/usr/lib/systemd/systemd-update-utmp" hostname=? addr=? terminal=? res=success' Nov 1 00:11:41.293220 systemd[1]: Finished systemd-update-utmp.service. Nov 1 00:11:41.294000 audit[1]: SERVICE_START pid=1 uid=0 auid=4294967295 ses=4294967295 subj=system_u:system_r:kernel_t:s0 msg='unit=systemd-update-utmp comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Nov 1 00:11:41.298275 systemd[1]: Finished clean-ca-certificates.service. Nov 1 00:11:41.299000 audit[1]: SERVICE_START pid=1 uid=0 auid=4294967295 ses=4294967295 subj=system_u:system_r:kernel_t:s0 msg='unit=clean-ca-certificates comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Nov 1 00:11:41.300602 systemd[1]: update-ca-certificates.service was skipped because of an unmet condition check (ConditionPathIsSymbolicLink=!/etc/ssl/certs/ca-certificates.crt). Nov 1 00:11:41.350090 systemd[1]: Finished systemd-journal-catalog-update.service. Nov 1 00:11:41.351000 audit[1]: SERVICE_START pid=1 uid=0 auid=4294967295 ses=4294967295 subj=system_u:system_r:kernel_t:s0 msg='unit=systemd-journal-catalog-update comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Nov 1 00:11:41.409000 audit: CONFIG_CHANGE auid=4294967295 ses=4294967295 subj=system_u:system_r:kernel_t:s0 op=add_rule key=(null) list=5 res=1 Nov 1 00:11:41.409000 audit[1694]: SYSCALL arch=c00000b7 syscall=206 success=yes exit=1056 a0=3 a1=ffffdd31fdd0 a2=420 a3=0 items=0 ppid=1674 pid=1694 auid=4294967295 uid=0 gid=0 euid=0 suid=0 fsuid=0 egid=0 sgid=0 fsgid=0 tty=(none) ses=4294967295 comm="auditctl" exe="/usr/sbin/auditctl" subj=system_u:system_r:kernel_t:s0 key=(null) Nov 1 00:11:41.409000 audit: PROCTITLE proctitle=2F7362696E2F617564697463746C002D52002F6574632F61756469742F61756469742E72756C6573 Nov 1 00:11:41.411391 augenrules[1694]: No rules Nov 1 00:11:41.412650 systemd[1]: Finished audit-rules.service. Nov 1 00:11:41.420053 systemd[1]: Started systemd-timesyncd.service. Nov 1 00:11:41.425036 systemd[1]: Reached target time-set.target. Nov 1 00:11:41.430778 systemd-resolved[1678]: Positive Trust Anchors: Nov 1 00:11:41.431939 systemd-resolved[1678]: . IN DS 20326 8 2 e06d44b80b8f1d39a95c0b0d7c65d08458e880409bbc683457104237c7f8ec8d Nov 1 00:11:41.432110 systemd-resolved[1678]: 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 168.192.in-addr.arpa d.f.ip6.arpa corp home internal intranet lan local private test Nov 1 00:11:41.491975 systemd-resolved[1678]: Defaulting to hostname 'linux'. Nov 1 00:11:41.495222 systemd[1]: Started systemd-resolved.service. Nov 1 00:11:41.497290 systemd[1]: Reached target network.target. Nov 1 00:11:41.499125 systemd[1]: Reached target nss-lookup.target. Nov 1 00:11:41.565138 systemd-timesyncd[1679]: Contacted time server 192.189.65.187:123 (0.flatcar.pool.ntp.org). Nov 1 00:11:41.565281 systemd-timesyncd[1679]: Initial clock synchronization to Sat 2025-11-01 00:11:41.674904 UTC. Nov 1 00:11:41.973034 ldconfig[1651]: /sbin/ldconfig: /lib/ld.so.conf is not an ELF file - it has the wrong magic bytes at the start. Nov 1 00:11:41.983185 systemd[1]: Finished ldconfig.service. Nov 1 00:11:41.987297 systemd[1]: Starting systemd-update-done.service... Nov 1 00:11:42.001790 systemd[1]: Finished systemd-update-done.service. Nov 1 00:11:42.004258 systemd[1]: Reached target sysinit.target. Nov 1 00:11:42.006255 systemd[1]: Started motdgen.path. Nov 1 00:11:42.008014 systemd[1]: Started user-cloudinit@var-lib-flatcar\x2dinstall-user_data.path. Nov 1 00:11:42.010874 systemd[1]: Started logrotate.timer. Nov 1 00:11:42.012814 systemd[1]: Started mdadm.timer. Nov 1 00:11:42.014365 systemd[1]: Started systemd-tmpfiles-clean.timer. Nov 1 00:11:42.016461 systemd[1]: update-engine-stub.timer was skipped because of an unmet condition check (ConditionPathExists=/usr/.noupdate). Nov 1 00:11:42.016514 systemd[1]: Reached target paths.target. Nov 1 00:11:42.018475 systemd[1]: Reached target timers.target. Nov 1 00:11:42.020893 systemd[1]: Listening on dbus.socket. Nov 1 00:11:42.024868 systemd[1]: Starting docker.socket... Nov 1 00:11:42.031761 systemd[1]: Listening on sshd.socket. Nov 1 00:11:42.033931 systemd[1]: systemd-pcrphase-sysinit.service was skipped because of an unmet condition check (ConditionPathExists=/sys/firmware/efi/efivars/StubPcrKernelImage-4a67b082-0a4c-41cf-b6c7-440b29bb8c4f). Nov 1 00:11:42.034941 systemd[1]: Listening on docker.socket. Nov 1 00:11:42.036944 systemd[1]: Reached target sockets.target. Nov 1 00:11:42.038921 systemd[1]: Reached target basic.target. Nov 1 00:11:42.040826 systemd[1]: addon-config@usr-share-oem.service was skipped because no trigger condition checks were met. Nov 1 00:11:42.041004 systemd[1]: addon-run@usr-share-oem.service was skipped because no trigger condition checks were met. Nov 1 00:11:42.043208 systemd[1]: Starting containerd.service... Nov 1 00:11:42.047872 systemd[1]: Starting coreos-metadata-sshkeys@core.service... Nov 1 00:11:42.052683 systemd[1]: Starting coreos-metadata.service... Nov 1 00:11:42.056883 systemd[1]: Starting dbus.service... Nov 1 00:11:42.065413 systemd[1]: Starting enable-oem-cloudinit.service... Nov 1 00:11:42.071108 systemd[1]: Starting extend-filesystems.service... Nov 1 00:11:42.073361 systemd[1]: flatcar-setup-environment.service was skipped because of an unmet condition check (ConditionPathExists=/usr/share/oem/bin/flatcar-setup-environment). Nov 1 00:11:42.081193 systemd[1]: Starting motdgen.service... Nov 1 00:11:42.107728 jq[1707]: false Nov 1 00:11:42.085185 systemd[1]: Starting ssh-key-proc-cmdline.service... Nov 1 00:11:42.089496 systemd[1]: Starting sshd-keygen.service... Nov 1 00:11:42.096816 systemd[1]: Starting systemd-logind.service... Nov 1 00:11:42.098811 systemd[1]: systemd-pcrphase.service was skipped because of an unmet condition check (ConditionPathExists=/sys/firmware/efi/efivars/StubPcrKernelImage-4a67b082-0a4c-41cf-b6c7-440b29bb8c4f). Nov 1 00:11:42.098946 systemd[1]: tcsd.service was skipped because of an unmet condition check (ConditionPathExists=/dev/tpm0). Nov 1 00:11:42.099900 systemd[1]: cgroup compatibility translation between legacy and unified hierarchy settings activated. See cgroup-compat debug messages for details. Nov 1 00:11:42.101937 systemd[1]: Starting update-engine.service... Nov 1 00:11:42.108452 systemd[1]: Starting update-ssh-keys-after-ignition.service... Nov 1 00:11:42.115564 systemd[1]: enable-oem-cloudinit.service: Skipped due to 'exec-condition'. Nov 1 00:11:42.116311 systemd[1]: Condition check resulted in enable-oem-cloudinit.service being skipped. Nov 1 00:11:42.127115 systemd[1]: Created slice system-sshd.slice. Nov 1 00:11:42.135265 jq[1716]: true Nov 1 00:11:42.138913 systemd-networkd[1541]: eth0: Gained IPv6LL Nov 1 00:11:42.143578 systemd[1]: Finished systemd-networkd-wait-online.service. Nov 1 00:11:42.148788 systemd[1]: Reached target network-online.target. Nov 1 00:11:42.163161 systemd[1]: Started amazon-ssm-agent.service. Nov 1 00:11:42.168957 systemd[1]: Started nvidia.service. Nov 1 00:11:42.186653 systemd[1]: ssh-key-proc-cmdline.service: Deactivated successfully. Nov 1 00:11:42.187101 systemd[1]: Finished ssh-key-proc-cmdline.service. Nov 1 00:11:42.191464 jq[1721]: true Nov 1 00:11:42.308916 dbus-daemon[1706]: [system] SELinux support is enabled Nov 1 00:11:42.309198 systemd[1]: Started dbus.service. Nov 1 00:11:42.314338 systemd[1]: system-cloudinit@usr-share-oem-cloud\x2dconfig.yml.service was skipped because of an unmet condition check (ConditionFileNotEmpty=/usr/share/oem/cloud-config.yml). Nov 1 00:11:42.315874 systemd[1]: Reached target system-config.target. Nov 1 00:11:42.318413 systemd[1]: user-cloudinit-proc-cmdline.service was skipped because of an unmet condition check (ConditionKernelCommandLine=cloud-config-url). Nov 1 00:11:42.318447 systemd[1]: Reached target user-config.target. Nov 1 00:11:42.340132 extend-filesystems[1708]: Found nvme0n1 Nov 1 00:11:42.342501 extend-filesystems[1708]: Found nvme0n1p1 Nov 1 00:11:42.355078 dbus-daemon[1706]: [system] Activating via systemd: service name='org.freedesktop.hostname1' unit='dbus-org.freedesktop.hostname1.service' requested by ':1.2' (uid=244 pid=1541 comm="/usr/lib/systemd/systemd-networkd" label="system_u:system_r:kernel_t:s0") Nov 1 00:11:42.360901 extend-filesystems[1708]: Found nvme0n1p2 Nov 1 00:11:42.362877 extend-filesystems[1708]: Found nvme0n1p3 Nov 1 00:11:42.365881 extend-filesystems[1708]: Found usr Nov 1 00:11:42.369992 systemd[1]: Starting systemd-hostnamed.service... Nov 1 00:11:42.389960 extend-filesystems[1708]: Found nvme0n1p4 Nov 1 00:11:42.394027 extend-filesystems[1708]: Found nvme0n1p6 Nov 1 00:11:42.396005 extend-filesystems[1708]: Found nvme0n1p7 Nov 1 00:11:42.400017 extend-filesystems[1708]: Found nvme0n1p9 Nov 1 00:11:42.402002 extend-filesystems[1708]: Checking size of /dev/nvme0n1p9 Nov 1 00:11:42.427982 systemd[1]: motdgen.service: Deactivated successfully. Nov 1 00:11:42.428364 systemd[1]: Finished motdgen.service. Nov 1 00:11:42.489276 extend-filesystems[1708]: Resized partition /dev/nvme0n1p9 Nov 1 00:11:42.498102 bash[1759]: Updated "/home/core/.ssh/authorized_keys" Nov 1 00:11:42.499601 systemd[1]: Finished update-ssh-keys-after-ignition.service. Nov 1 00:11:42.505674 update_engine[1714]: I1101 00:11:42.505177 1714 main.cc:92] Flatcar Update Engine starting Nov 1 00:11:42.512727 extend-filesystems[1769]: resize2fs 1.46.5 (30-Dec-2021) Nov 1 00:11:42.522016 systemd[1]: Started update-engine.service. Nov 1 00:11:42.524047 update_engine[1714]: I1101 00:11:42.524008 1714 update_check_scheduler.cc:74] Next update check in 7m37s Nov 1 00:11:42.527065 systemd[1]: Started locksmithd.service. Nov 1 00:11:42.592745 kernel: EXT4-fs (nvme0n1p9): resizing filesystem from 553472 to 3587067 blocks Nov 1 00:11:42.653928 env[1723]: time="2025-11-01T00:11:42.653847173Z" level=info msg="starting containerd" revision=92b3a9d6f1b3bcc6dc74875cfdea653fe39f09c2 version=1.6.16 Nov 1 00:11:42.695759 kernel: EXT4-fs (nvme0n1p9): resized filesystem to 3587067 Nov 1 00:11:42.717823 extend-filesystems[1769]: Filesystem at /dev/nvme0n1p9 is mounted on /; on-line resizing required Nov 1 00:11:42.717823 extend-filesystems[1769]: old_desc_blocks = 1, new_desc_blocks = 2 Nov 1 00:11:42.717823 extend-filesystems[1769]: The filesystem on /dev/nvme0n1p9 is now 3587067 (4k) blocks long. Nov 1 00:11:42.741624 extend-filesystems[1708]: Resized filesystem in /dev/nvme0n1p9 Nov 1 00:11:42.728524 systemd[1]: extend-filesystems.service: Deactivated successfully. Nov 1 00:11:42.728924 systemd[1]: Finished extend-filesystems.service. Nov 1 00:11:42.775734 env[1723]: time="2025-11-01T00:11:42.772400093Z" level=info msg="loading plugin \"io.containerd.content.v1.content\"..." type=io.containerd.content.v1 Nov 1 00:11:42.775734 env[1723]: time="2025-11-01T00:11:42.772932540Z" level=info msg="loading plugin \"io.containerd.snapshotter.v1.aufs\"..." type=io.containerd.snapshotter.v1 Nov 1 00:11:42.775734 env[1723]: time="2025-11-01T00:11:42.775381024Z" level=info msg="skip loading plugin \"io.containerd.snapshotter.v1.aufs\"..." error="aufs is not supported (modprobe aufs failed: exit status 1 \"modprobe: FATAL: Module aufs not found in directory /lib/modules/5.15.192-flatcar\\n\"): skip plugin" type=io.containerd.snapshotter.v1 Nov 1 00:11:42.775734 env[1723]: time="2025-11-01T00:11:42.775439172Z" level=info msg="loading plugin \"io.containerd.snapshotter.v1.btrfs\"..." type=io.containerd.snapshotter.v1 Nov 1 00:11:42.776047 env[1723]: time="2025-11-01T00:11:42.775828000Z" level=info msg="skip loading plugin \"io.containerd.snapshotter.v1.btrfs\"..." error="path /var/lib/containerd/io.containerd.snapshotter.v1.btrfs (ext4) must be a btrfs filesystem to be used with the btrfs snapshotter: skip plugin" type=io.containerd.snapshotter.v1 Nov 1 00:11:42.776047 env[1723]: time="2025-11-01T00:11:42.775866161Z" level=info msg="loading plugin \"io.containerd.snapshotter.v1.devmapper\"..." type=io.containerd.snapshotter.v1 Nov 1 00:11:42.776047 env[1723]: time="2025-11-01T00:11:42.775905296Z" level=warning msg="failed to load plugin io.containerd.snapshotter.v1.devmapper" error="devmapper not configured" Nov 1 00:11:42.776047 env[1723]: time="2025-11-01T00:11:42.775932278Z" level=info msg="loading plugin \"io.containerd.snapshotter.v1.native\"..." type=io.containerd.snapshotter.v1 Nov 1 00:11:42.776256 env[1723]: time="2025-11-01T00:11:42.776110190Z" level=info msg="loading plugin \"io.containerd.snapshotter.v1.overlayfs\"..." type=io.containerd.snapshotter.v1 Nov 1 00:11:42.776772 env[1723]: time="2025-11-01T00:11:42.776719300Z" level=info msg="loading plugin \"io.containerd.snapshotter.v1.zfs\"..." type=io.containerd.snapshotter.v1 Nov 1 00:11:42.777023 env[1723]: time="2025-11-01T00:11:42.776971917Z" level=info msg="skip loading plugin \"io.containerd.snapshotter.v1.zfs\"..." error="path /var/lib/containerd/io.containerd.snapshotter.v1.zfs must be a zfs filesystem to be used with the zfs snapshotter: skip plugin" type=io.containerd.snapshotter.v1 Nov 1 00:11:42.777093 env[1723]: time="2025-11-01T00:11:42.777017949Z" level=info msg="loading plugin \"io.containerd.metadata.v1.bolt\"..." type=io.containerd.metadata.v1 Nov 1 00:11:42.778568 env[1723]: time="2025-11-01T00:11:42.777144513Z" level=warning msg="could not use snapshotter devmapper in metadata plugin" error="devmapper not configured" Nov 1 00:11:42.778568 env[1723]: time="2025-11-01T00:11:42.777181665Z" level=info msg="metadata content store policy set" policy=shared Nov 1 00:11:42.789931 env[1723]: time="2025-11-01T00:11:42.789851817Z" level=info msg="loading plugin \"io.containerd.differ.v1.walking\"..." type=io.containerd.differ.v1 Nov 1 00:11:42.790078 env[1723]: time="2025-11-01T00:11:42.789935913Z" level=info msg="loading plugin \"io.containerd.event.v1.exchange\"..." type=io.containerd.event.v1 Nov 1 00:11:42.790078 env[1723]: time="2025-11-01T00:11:42.789972384Z" level=info msg="loading plugin \"io.containerd.gc.v1.scheduler\"..." type=io.containerd.gc.v1 Nov 1 00:11:42.790078 env[1723]: time="2025-11-01T00:11:42.790061042Z" level=info msg="loading plugin \"io.containerd.service.v1.introspection-service\"..." type=io.containerd.service.v1 Nov 1 00:11:42.790266 env[1723]: time="2025-11-01T00:11:42.790232847Z" level=info msg="loading plugin \"io.containerd.service.v1.containers-service\"..." type=io.containerd.service.v1 Nov 1 00:11:42.790325 env[1723]: time="2025-11-01T00:11:42.790274999Z" level=info msg="loading plugin \"io.containerd.service.v1.content-service\"..." type=io.containerd.service.v1 Nov 1 00:11:42.790325 env[1723]: time="2025-11-01T00:11:42.790307455Z" level=info msg="loading plugin \"io.containerd.service.v1.diff-service\"..." type=io.containerd.service.v1 Nov 1 00:11:42.790956 env[1723]: time="2025-11-01T00:11:42.790886676Z" level=info msg="loading plugin \"io.containerd.service.v1.images-service\"..." type=io.containerd.service.v1 Nov 1 00:11:42.791070 env[1723]: time="2025-11-01T00:11:42.790956284Z" level=info msg="loading plugin \"io.containerd.service.v1.leases-service\"..." type=io.containerd.service.v1 Nov 1 00:11:42.791070 env[1723]: time="2025-11-01T00:11:42.790991611Z" level=info msg="loading plugin \"io.containerd.service.v1.namespaces-service\"..." type=io.containerd.service.v1 Nov 1 00:11:42.791070 env[1723]: time="2025-11-01T00:11:42.791022947Z" level=info msg="loading plugin \"io.containerd.service.v1.snapshots-service\"..." type=io.containerd.service.v1 Nov 1 00:11:42.791070 env[1723]: time="2025-11-01T00:11:42.791053639Z" level=info msg="loading plugin \"io.containerd.runtime.v1.linux\"..." type=io.containerd.runtime.v1 Nov 1 00:11:42.791355 env[1723]: time="2025-11-01T00:11:42.791308288Z" level=info msg="loading plugin \"io.containerd.runtime.v2.task\"..." type=io.containerd.runtime.v2 Nov 1 00:11:42.791549 env[1723]: time="2025-11-01T00:11:42.791503559Z" level=info msg="loading plugin \"io.containerd.monitor.v1.cgroups\"..." type=io.containerd.monitor.v1 Nov 1 00:11:42.792294 env[1723]: time="2025-11-01T00:11:42.792245061Z" level=info msg="loading plugin \"io.containerd.service.v1.tasks-service\"..." type=io.containerd.service.v1 Nov 1 00:11:42.792370 env[1723]: time="2025-11-01T00:11:42.792309389Z" level=info msg="loading plugin \"io.containerd.grpc.v1.introspection\"..." type=io.containerd.grpc.v1 Nov 1 00:11:42.792370 env[1723]: time="2025-11-01T00:11:42.792343280Z" level=info msg="loading plugin \"io.containerd.internal.v1.restart\"..." type=io.containerd.internal.v1 Nov 1 00:11:42.792624 env[1723]: time="2025-11-01T00:11:42.792579657Z" level=info msg="loading plugin \"io.containerd.grpc.v1.containers\"..." type=io.containerd.grpc.v1 Nov 1 00:11:42.792776 env[1723]: time="2025-11-01T00:11:42.792734480Z" level=info msg="loading plugin \"io.containerd.grpc.v1.content\"..." type=io.containerd.grpc.v1 Nov 1 00:11:42.792842 env[1723]: time="2025-11-01T00:11:42.792780634Z" level=info msg="loading plugin \"io.containerd.grpc.v1.diff\"..." type=io.containerd.grpc.v1 Nov 1 00:11:42.792842 env[1723]: time="2025-11-01T00:11:42.792815815Z" level=info msg="loading plugin \"io.containerd.grpc.v1.events\"..." type=io.containerd.grpc.v1 Nov 1 00:11:42.792945 env[1723]: time="2025-11-01T00:11:42.792848283Z" level=info msg="loading plugin \"io.containerd.grpc.v1.healthcheck\"..." type=io.containerd.grpc.v1 Nov 1 00:11:42.792945 env[1723]: time="2025-11-01T00:11:42.792879608Z" level=info msg="loading plugin \"io.containerd.grpc.v1.images\"..." type=io.containerd.grpc.v1 Nov 1 00:11:42.792945 env[1723]: time="2025-11-01T00:11:42.792908804Z" level=info msg="loading plugin \"io.containerd.grpc.v1.leases\"..." type=io.containerd.grpc.v1 Nov 1 00:11:42.792945 env[1723]: time="2025-11-01T00:11:42.792937768Z" level=info msg="loading plugin \"io.containerd.grpc.v1.namespaces\"..." type=io.containerd.grpc.v1 Nov 1 00:11:42.793165 env[1723]: time="2025-11-01T00:11:42.792976599Z" level=info msg="loading plugin \"io.containerd.internal.v1.opt\"..." type=io.containerd.internal.v1 Nov 1 00:11:42.793308 env[1723]: time="2025-11-01T00:11:42.793261477Z" level=info msg="loading plugin \"io.containerd.grpc.v1.snapshots\"..." type=io.containerd.grpc.v1 Nov 1 00:11:42.793388 env[1723]: time="2025-11-01T00:11:42.793318008Z" level=info msg="loading plugin \"io.containerd.grpc.v1.tasks\"..." type=io.containerd.grpc.v1 Nov 1 00:11:42.793388 env[1723]: time="2025-11-01T00:11:42.793351571Z" level=info msg="loading plugin \"io.containerd.grpc.v1.version\"..." type=io.containerd.grpc.v1 Nov 1 00:11:42.793509 env[1723]: time="2025-11-01T00:11:42.793381229Z" level=info msg="loading plugin \"io.containerd.tracing.processor.v1.otlp\"..." type=io.containerd.tracing.processor.v1 Nov 1 00:11:42.793509 env[1723]: time="2025-11-01T00:11:42.793417334Z" level=info msg="skip loading plugin \"io.containerd.tracing.processor.v1.otlp\"..." error="no OpenTelemetry endpoint: skip plugin" type=io.containerd.tracing.processor.v1 Nov 1 00:11:42.793509 env[1723]: time="2025-11-01T00:11:42.793445776Z" level=info msg="loading plugin \"io.containerd.internal.v1.tracing\"..." type=io.containerd.internal.v1 Nov 1 00:11:42.793509 env[1723]: time="2025-11-01T00:11:42.793490859Z" level=error msg="failed to initialize a tracing processor \"otlp\"" error="no OpenTelemetry endpoint: skip plugin" Nov 1 00:11:42.793734 env[1723]: time="2025-11-01T00:11:42.793566939Z" level=info msg="loading plugin \"io.containerd.grpc.v1.cri\"..." type=io.containerd.grpc.v1 Nov 1 00:11:42.794063 env[1723]: time="2025-11-01T00:11:42.793950195Z" level=info msg="Start cri plugin with config {PluginConfig:{ContainerdConfig:{Snapshotter:overlayfs DefaultRuntimeName:runc DefaultRuntime:{Type: Path: Engine: PodAnnotations:[] ContainerAnnotations:[] Root: Options:map[] PrivilegedWithoutHostDevices:false BaseRuntimeSpec: NetworkPluginConfDir: NetworkPluginMaxConfNum:0} UntrustedWorkloadRuntime:{Type: Path: Engine: PodAnnotations:[] ContainerAnnotations:[] Root: Options:map[] PrivilegedWithoutHostDevices:false BaseRuntimeSpec: NetworkPluginConfDir: NetworkPluginMaxConfNum:0} Runtimes:map[runc:{Type:io.containerd.runc.v2 Path: Engine: PodAnnotations:[] ContainerAnnotations:[] Root: Options:map[SystemdCgroup:true] PrivilegedWithoutHostDevices:false BaseRuntimeSpec: NetworkPluginConfDir: NetworkPluginMaxConfNum:0}] NoPivot:false DisableSnapshotAnnotations:true DiscardUnpackedLayers:false IgnoreRdtNotEnabledErrors:false} CniConfig:{NetworkPluginBinDir:/opt/cni/bin NetworkPluginConfDir:/etc/cni/net.d NetworkPluginMaxConfNum:1 NetworkPluginConfTemplate: IPPreference:} Registry:{ConfigPath: Mirrors:map[] Configs:map[] Auths:map[] Headers:map[]} ImageDecryption:{KeyModel:node} DisableTCPService:true StreamServerAddress:127.0.0.1 StreamServerPort:0 StreamIdleTimeout:4h0m0s EnableSelinux:true SelinuxCategoryRange:1024 SandboxImage:registry.k8s.io/pause:3.6 StatsCollectPeriod:10 SystemdCgroup:false EnableTLSStreaming:false X509KeyPairStreaming:{TLSCertFile: TLSKeyFile:} MaxContainerLogLineSize:16384 DisableCgroup:false DisableApparmor:false RestrictOOMScoreAdj:false MaxConcurrentDownloads:3 DisableProcMount:false UnsetSeccompProfile: TolerateMissingHugetlbController:true DisableHugetlbController:true DeviceOwnershipFromSecurityContext:false IgnoreImageDefinedVolumes:false NetNSMountsUnderStateDir:false EnableUnprivilegedPorts:false EnableUnprivilegedICMP:false} ContainerdRootDir:/var/lib/containerd ContainerdEndpoint:/run/containerd/containerd.sock RootDir:/var/lib/containerd/io.containerd.grpc.v1.cri StateDir:/run/containerd/io.containerd.grpc.v1.cri}" Nov 1 00:11:42.796229 env[1723]: time="2025-11-01T00:11:42.794067002Z" level=info msg="Connect containerd service" Nov 1 00:11:42.796229 env[1723]: time="2025-11-01T00:11:42.794128143Z" level=info msg="Get image filesystem path \"/var/lib/containerd/io.containerd.snapshotter.v1.overlayfs\"" Nov 1 00:11:42.796229 env[1723]: time="2025-11-01T00:11:42.795476151Z" level=error msg="failed to load cni during init, please check CRI plugin status before setting up network for pods" error="cni config load failed: no network config found in /etc/cni/net.d: cni plugin not initialized: failed to load cni config" Nov 1 00:11:42.796229 env[1723]: time="2025-11-01T00:11:42.796082804Z" level=info msg=serving... address=/run/containerd/containerd.sock.ttrpc Nov 1 00:11:42.796229 env[1723]: time="2025-11-01T00:11:42.796177411Z" level=info msg=serving... address=/run/containerd/containerd.sock Nov 1 00:11:42.798640 env[1723]: time="2025-11-01T00:11:42.796278465Z" level=info msg="containerd successfully booted in 0.143893s" Nov 1 00:11:42.796415 systemd[1]: Started containerd.service. Nov 1 00:11:42.799885 env[1723]: time="2025-11-01T00:11:42.799792342Z" level=info msg="Start subscribing containerd event" Nov 1 00:11:42.800019 env[1723]: time="2025-11-01T00:11:42.799918967Z" level=info msg="Start recovering state" Nov 1 00:11:42.800079 env[1723]: time="2025-11-01T00:11:42.800056941Z" level=info msg="Start event monitor" Nov 1 00:11:42.800165 env[1723]: time="2025-11-01T00:11:42.800106732Z" level=info msg="Start snapshots syncer" Nov 1 00:11:42.800165 env[1723]: time="2025-11-01T00:11:42.800137546Z" level=info msg="Start cni network conf syncer for default" Nov 1 00:11:42.800274 env[1723]: time="2025-11-01T00:11:42.800232055Z" level=info msg="Start streaming server" Nov 1 00:11:42.833186 amazon-ssm-agent[1726]: 2025/11/01 00:11:42 Failed to load instance info from vault. RegistrationKey does not exist. Nov 1 00:11:42.864275 dbus-daemon[1706]: [system] Successfully activated service 'org.freedesktop.hostname1' Nov 1 00:11:42.864526 systemd[1]: Started systemd-hostnamed.service. Nov 1 00:11:42.868564 dbus-daemon[1706]: [system] Activating via systemd: service name='org.freedesktop.PolicyKit1' unit='polkit.service' requested by ':1.5' (uid=0 pid=1758 comm="/usr/lib/systemd/systemd-hostnamed" label="system_u:system_r:kernel_t:s0") Nov 1 00:11:42.872807 systemd[1]: Starting polkit.service... Nov 1 00:11:42.875837 amazon-ssm-agent[1726]: Initializing new seelog logger Nov 1 00:11:42.879019 amazon-ssm-agent[1726]: New Seelog Logger Creation Complete Nov 1 00:11:42.882098 amazon-ssm-agent[1726]: 2025/11/01 00:11:42 Found config file at /etc/amazon/ssm/amazon-ssm-agent.json. Nov 1 00:11:42.889272 amazon-ssm-agent[1726]: Applying config override from /etc/amazon/ssm/amazon-ssm-agent.json. Nov 1 00:11:42.889972 amazon-ssm-agent[1726]: 2025/11/01 00:11:42 processing appconfig overrides Nov 1 00:11:42.906894 systemd[1]: nvidia.service: Deactivated successfully. Nov 1 00:11:42.910072 polkitd[1839]: Started polkitd version 121 Nov 1 00:11:42.939527 polkitd[1839]: Loading rules from directory /etc/polkit-1/rules.d Nov 1 00:11:42.939640 polkitd[1839]: Loading rules from directory /usr/share/polkit-1/rules.d Nov 1 00:11:42.949255 systemd-logind[1712]: Watching system buttons on /dev/input/event0 (Power Button) Nov 1 00:11:42.950853 polkitd[1839]: Finished loading, compiling and executing 2 rules Nov 1 00:11:42.951631 dbus-daemon[1706]: [system] Successfully activated service 'org.freedesktop.PolicyKit1' Nov 1 00:11:42.951904 systemd[1]: Started polkit.service. Nov 1 00:11:42.952727 systemd-logind[1712]: Watching system buttons on /dev/input/event1 (Sleep Button) Nov 1 00:11:42.954116 polkitd[1839]: Acquired the name org.freedesktop.PolicyKit1 on the system bus Nov 1 00:11:42.956197 systemd-logind[1712]: New seat seat0. Nov 1 00:11:42.992314 systemd-hostnamed[1758]: Hostname set to (transient) Nov 1 00:11:42.992487 systemd-resolved[1678]: System hostname changed to 'ip-172-31-30-200'. Nov 1 00:11:43.058930 systemd[1]: Started systemd-logind.service. Nov 1 00:11:43.136073 coreos-metadata[1704]: Nov 01 00:11:43.133 INFO Putting http://169.254.169.254/latest/api/token: Attempt #1 Nov 1 00:11:43.139817 coreos-metadata[1704]: Nov 01 00:11:43.139 INFO Fetching http://169.254.169.254/2019-10-01/meta-data/public-keys: Attempt #1 Nov 1 00:11:43.142573 coreos-metadata[1704]: Nov 01 00:11:43.142 INFO Fetch successful Nov 1 00:11:43.142573 coreos-metadata[1704]: Nov 01 00:11:43.142 INFO Fetching http://169.254.169.254/2019-10-01/meta-data/public-keys/0/openssh-key: Attempt #1 Nov 1 00:11:43.145150 coreos-metadata[1704]: Nov 01 00:11:43.144 INFO Fetch successful Nov 1 00:11:43.151327 unknown[1704]: wrote ssh authorized keys file for user: core Nov 1 00:11:43.176703 update-ssh-keys[1872]: Updated "/home/core/.ssh/authorized_keys" Nov 1 00:11:43.177485 systemd[1]: Finished coreos-metadata-sshkeys@core.service. Nov 1 00:11:43.313782 coreos-metadata[1705]: Nov 01 00:11:43.313 INFO Putting http://169.254.169.254/latest/api/token: Attempt #1 Nov 1 00:11:43.315193 coreos-metadata[1705]: Nov 01 00:11:43.315 INFO Fetching http://169.254.169.254/2019-10-01/meta-data/instance-id: Attempt #1 Nov 1 00:11:43.316076 coreos-metadata[1705]: Nov 01 00:11:43.315 INFO Fetch successful Nov 1 00:11:43.316076 coreos-metadata[1705]: Nov 01 00:11:43.315 INFO Fetching http://169.254.169.254/2019-10-01/meta-data/instance-type: Attempt #1 Nov 1 00:11:43.317063 coreos-metadata[1705]: Nov 01 00:11:43.316 INFO Fetch successful Nov 1 00:11:43.317063 coreos-metadata[1705]: Nov 01 00:11:43.316 INFO Fetching http://169.254.169.254/2019-10-01/meta-data/local-ipv4: Attempt #1 Nov 1 00:11:43.317949 coreos-metadata[1705]: Nov 01 00:11:43.317 INFO Fetch successful Nov 1 00:11:43.317949 coreos-metadata[1705]: Nov 01 00:11:43.317 INFO Fetching http://169.254.169.254/2019-10-01/meta-data/public-ipv4: Attempt #1 Nov 1 00:11:43.318831 coreos-metadata[1705]: Nov 01 00:11:43.318 INFO Fetch successful Nov 1 00:11:43.318831 coreos-metadata[1705]: Nov 01 00:11:43.318 INFO Fetching http://169.254.169.254/2019-10-01/meta-data/placement/availability-zone: Attempt #1 Nov 1 00:11:43.319729 coreos-metadata[1705]: Nov 01 00:11:43.319 INFO Fetch successful Nov 1 00:11:43.319729 coreos-metadata[1705]: Nov 01 00:11:43.319 INFO Fetching http://169.254.169.254/2019-10-01/meta-data/hostname: Attempt #1 Nov 1 00:11:43.320521 coreos-metadata[1705]: Nov 01 00:11:43.320 INFO Fetch successful Nov 1 00:11:43.320521 coreos-metadata[1705]: Nov 01 00:11:43.320 INFO Fetching http://169.254.169.254/2019-10-01/meta-data/public-hostname: Attempt #1 Nov 1 00:11:43.321402 coreos-metadata[1705]: Nov 01 00:11:43.321 INFO Fetch successful Nov 1 00:11:43.321402 coreos-metadata[1705]: Nov 01 00:11:43.321 INFO Fetching http://169.254.169.254/2019-10-01/dynamic/instance-identity/document: Attempt #1 Nov 1 00:11:43.322492 coreos-metadata[1705]: Nov 01 00:11:43.322 INFO Fetch successful Nov 1 00:11:43.338351 systemd[1]: Finished coreos-metadata.service. Nov 1 00:11:43.343461 systemd[1]: Starting etcd-member.service... Nov 1 00:11:43.465115 systemd[1]: Starting docker.service... Nov 1 00:11:43.509456 amazon-ssm-agent[1726]: 2025-11-01 00:11:43 INFO Create new startup processor Nov 1 00:11:43.510072 amazon-ssm-agent[1726]: 2025-11-01 00:11:43 INFO [LongRunningPluginsManager] registered plugins: {} Nov 1 00:11:43.510791 amazon-ssm-agent[1726]: 2025-11-01 00:11:43 INFO Initializing bookkeeping folders Nov 1 00:11:43.510942 amazon-ssm-agent[1726]: 2025-11-01 00:11:43 INFO removing the completed state files Nov 1 00:11:43.511059 amazon-ssm-agent[1726]: 2025-11-01 00:11:43 INFO Initializing bookkeeping folders for long running plugins Nov 1 00:11:43.511175 amazon-ssm-agent[1726]: 2025-11-01 00:11:43 INFO Initializing replies folder for MDS reply requests that couldn't reach the service Nov 1 00:11:43.511312 amazon-ssm-agent[1726]: 2025-11-01 00:11:43 INFO Initializing healthcheck folders for long running plugins Nov 1 00:11:43.511425 amazon-ssm-agent[1726]: 2025-11-01 00:11:43 INFO Initializing locations for inventory plugin Nov 1 00:11:43.513847 amazon-ssm-agent[1726]: 2025-11-01 00:11:43 INFO Initializing default location for custom inventory Nov 1 00:11:43.514005 amazon-ssm-agent[1726]: 2025-11-01 00:11:43 INFO Initializing default location for file inventory Nov 1 00:11:43.514118 amazon-ssm-agent[1726]: 2025-11-01 00:11:43 INFO Initializing default location for role inventory Nov 1 00:11:43.514232 amazon-ssm-agent[1726]: 2025-11-01 00:11:43 INFO Init the cloudwatchlogs publisher Nov 1 00:11:43.514348 amazon-ssm-agent[1726]: 2025-11-01 00:11:43 INFO [instanceID=i-0977097823e8c0c7d] Successfully loaded platform independent plugin aws:runPowerShellScript Nov 1 00:11:43.514462 amazon-ssm-agent[1726]: 2025-11-01 00:11:43 INFO [instanceID=i-0977097823e8c0c7d] Successfully loaded platform independent plugin aws:runDockerAction Nov 1 00:11:43.514574 amazon-ssm-agent[1726]: 2025-11-01 00:11:43 INFO [instanceID=i-0977097823e8c0c7d] Successfully loaded platform independent plugin aws:configurePackage Nov 1 00:11:43.514715 amazon-ssm-agent[1726]: 2025-11-01 00:11:43 INFO [instanceID=i-0977097823e8c0c7d] Successfully loaded platform independent plugin aws:runDocument Nov 1 00:11:43.514856 amazon-ssm-agent[1726]: 2025-11-01 00:11:43 INFO [instanceID=i-0977097823e8c0c7d] Successfully loaded platform independent plugin aws:softwareInventory Nov 1 00:11:43.514970 amazon-ssm-agent[1726]: 2025-11-01 00:11:43 INFO [instanceID=i-0977097823e8c0c7d] Successfully loaded platform independent plugin aws:updateSsmAgent Nov 1 00:11:43.515083 amazon-ssm-agent[1726]: 2025-11-01 00:11:43 INFO [instanceID=i-0977097823e8c0c7d] Successfully loaded platform independent plugin aws:configureDocker Nov 1 00:11:43.515197 amazon-ssm-agent[1726]: 2025-11-01 00:11:43 INFO [instanceID=i-0977097823e8c0c7d] Successfully loaded platform independent plugin aws:refreshAssociation Nov 1 00:11:43.515323 amazon-ssm-agent[1726]: 2025-11-01 00:11:43 INFO [instanceID=i-0977097823e8c0c7d] Successfully loaded platform independent plugin aws:downloadContent Nov 1 00:11:43.515436 amazon-ssm-agent[1726]: 2025-11-01 00:11:43 INFO [instanceID=i-0977097823e8c0c7d] Successfully loaded platform dependent plugin aws:runShellScript Nov 1 00:11:43.515547 amazon-ssm-agent[1726]: 2025-11-01 00:11:43 INFO Starting Agent: amazon-ssm-agent - v2.3.1319.0 Nov 1 00:11:43.515659 amazon-ssm-agent[1726]: 2025-11-01 00:11:43 INFO OS: linux, Arch: arm64 Nov 1 00:11:43.517115 amazon-ssm-agent[1726]: datastore file /var/lib/amazon/ssm/i-0977097823e8c0c7d/longrunningplugins/datastore/store doesn't exist - no long running plugins to execute Nov 1 00:11:43.517686 amazon-ssm-agent[1726]: 2025-11-01 00:11:43 INFO [MessagingDeliveryService] Starting document processing engine... Nov 1 00:11:43.616032 amazon-ssm-agent[1726]: 2025-11-01 00:11:43 INFO [MessagingDeliveryService] [EngineProcessor] Starting Nov 1 00:11:43.650885 env[1905]: time="2025-11-01T00:11:43.650817286Z" level=info msg="Starting up" Nov 1 00:11:43.658756 env[1905]: time="2025-11-01T00:11:43.657468751Z" level=info msg="parsed scheme: \"unix\"" module=grpc Nov 1 00:11:43.658756 env[1905]: time="2025-11-01T00:11:43.657507674Z" level=info msg="scheme \"unix\" not registered, fallback to default scheme" module=grpc Nov 1 00:11:43.658756 env[1905]: time="2025-11-01T00:11:43.657543463Z" level=info msg="ccResolverWrapper: sending update to cc: {[{unix:///var/run/docker/libcontainerd/docker-containerd.sock 0 }] }" module=grpc Nov 1 00:11:43.658756 env[1905]: time="2025-11-01T00:11:43.657567752Z" level=info msg="ClientConn switching balancer to \"pick_first\"" module=grpc Nov 1 00:11:43.672282 env[1905]: time="2025-11-01T00:11:43.672237367Z" level=info msg="parsed scheme: \"unix\"" module=grpc Nov 1 00:11:43.672461 env[1905]: time="2025-11-01T00:11:43.672433231Z" level=info msg="scheme \"unix\" not registered, fallback to default scheme" module=grpc Nov 1 00:11:43.672590 env[1905]: time="2025-11-01T00:11:43.672558026Z" level=info msg="ccResolverWrapper: sending update to cc: {[{unix:///var/run/docker/libcontainerd/docker-containerd.sock 0 }] }" module=grpc Nov 1 00:11:43.672722 env[1905]: time="2025-11-01T00:11:43.672669195Z" level=info msg="ClientConn switching balancer to \"pick_first\"" module=grpc Nov 1 00:11:43.681291 systemd[1]: var-lib-docker-check\x2doverlayfs\x2dsupport3002125059-merged.mount: Deactivated successfully. Nov 1 00:11:43.710641 amazon-ssm-agent[1726]: 2025-11-01 00:11:43 INFO [MessagingDeliveryService] [EngineProcessor] Initial processing Nov 1 00:11:43.737010 env[1905]: time="2025-11-01T00:11:43.736360647Z" level=info msg="Loading containers: start." Nov 1 00:11:43.805229 amazon-ssm-agent[1726]: 2025-11-01 00:11:43 INFO [MessagingDeliveryService] Starting message polling Nov 1 00:11:43.838541 locksmithd[1770]: locksmithd starting currentOperation="UPDATE_STATUS_IDLE" strategy="reboot" Nov 1 00:11:43.900019 amazon-ssm-agent[1726]: 2025-11-01 00:11:43 INFO [MessagingDeliveryService] Starting send replies to MDS Nov 1 00:11:43.995063 amazon-ssm-agent[1726]: 2025-11-01 00:11:43 INFO [instanceID=i-0977097823e8c0c7d] Starting association polling Nov 1 00:11:44.012061 kernel: Initializing XFRM netlink socket Nov 1 00:11:44.090080 amazon-ssm-agent[1726]: 2025-11-01 00:11:43 INFO [MessagingDeliveryService] [Association] [EngineProcessor] Starting Nov 1 00:11:44.091292 env[1905]: time="2025-11-01T00:11:44.091247494Z" level=info msg="Default bridge (docker0) is assigned with an IP address 172.17.0.0/16. Daemon option --bip can be used to set a preferred IP address" Nov 1 00:11:44.095304 (udev-worker)[1544]: Network interface NamePolicy= disabled on kernel command line. Nov 1 00:11:44.185416 amazon-ssm-agent[1726]: 2025-11-01 00:11:43 INFO [MessagingDeliveryService] [Association] Launching response handler Nov 1 00:11:44.205209 systemd-networkd[1541]: docker0: Link UP Nov 1 00:11:44.233982 env[1905]: time="2025-11-01T00:11:44.233937132Z" level=info msg="Loading containers: done." Nov 1 00:11:44.264391 systemd[1]: var-lib-docker-overlay2-opaque\x2dbug\x2dcheck135088994-merged.mount: Deactivated successfully. Nov 1 00:11:44.275670 env[1905]: time="2025-11-01T00:11:44.275605063Z" level=warning msg="Not using native diff for overlay2, this may cause degraded performance for building images: kernel has CONFIG_OVERLAY_FS_REDIRECT_DIR enabled" storage-driver=overlay2 Nov 1 00:11:44.275974 env[1905]: time="2025-11-01T00:11:44.275929162Z" level=info msg="Docker daemon" commit=112bdf3343 graphdriver(s)=overlay2 version=20.10.23 Nov 1 00:11:44.276157 env[1905]: time="2025-11-01T00:11:44.276120284Z" level=info msg="Daemon has completed initialization" Nov 1 00:11:44.280905 amazon-ssm-agent[1726]: 2025-11-01 00:11:43 INFO [MessagingDeliveryService] [Association] [EngineProcessor] Initial processing Nov 1 00:11:44.309487 systemd[1]: Started docker.service. Nov 1 00:11:44.321401 env[1905]: time="2025-11-01T00:11:44.321138935Z" level=info msg="API listen on /run/docker.sock" Nov 1 00:11:44.323749 etcd-wrapper[1899]: Error response from daemon: No such container: etcd-member Nov 1 00:11:44.367230 etcd-wrapper[2019]: Error: No such container: etcd-member Nov 1 00:11:44.376645 amazon-ssm-agent[1726]: 2025-11-01 00:11:43 INFO [MessagingDeliveryService] [Association] Initializing association scheduling service Nov 1 00:11:44.463994 etcd-wrapper[2037]: Unable to find image 'quay.io/coreos/etcd:v3.5.22' locally Nov 1 00:11:44.472510 amazon-ssm-agent[1726]: 2025-11-01 00:11:43 INFO [MessagingDeliveryService] [Association] Association scheduling service initialized Nov 1 00:11:44.568762 amazon-ssm-agent[1726]: 2025-11-01 00:11:43 INFO [MessageGatewayService] Starting session document processing engine... Nov 1 00:11:44.665031 amazon-ssm-agent[1726]: 2025-11-01 00:11:43 INFO [MessageGatewayService] [EngineProcessor] Starting Nov 1 00:11:44.761885 amazon-ssm-agent[1726]: 2025-11-01 00:11:43 INFO [MessageGatewayService] SSM Agent is trying to setup control channel for Session Manager module. Nov 1 00:11:44.858560 amazon-ssm-agent[1726]: 2025-11-01 00:11:43 INFO [MessageGatewayService] Setting up websocket for controlchannel for instance: i-0977097823e8c0c7d, requestId: d1043dce-c7b8-4899-bf4f-075ef05a2649 Nov 1 00:11:44.955426 amazon-ssm-agent[1726]: 2025-11-01 00:11:43 INFO [OfflineService] Starting document processing engine... Nov 1 00:11:45.052531 amazon-ssm-agent[1726]: 2025-11-01 00:11:43 INFO [OfflineService] [EngineProcessor] Starting Nov 1 00:11:45.149956 amazon-ssm-agent[1726]: 2025-11-01 00:11:43 INFO [OfflineService] [EngineProcessor] Initial processing Nov 1 00:11:45.247345 amazon-ssm-agent[1726]: 2025-11-01 00:11:43 INFO [OfflineService] Starting message polling Nov 1 00:11:45.345025 amazon-ssm-agent[1726]: 2025-11-01 00:11:43 INFO [OfflineService] Starting send replies to MDS Nov 1 00:11:45.442996 amazon-ssm-agent[1726]: 2025-11-01 00:11:43 INFO [LongRunningPluginsManager] starting long running plugin manager Nov 1 00:11:45.540996 amazon-ssm-agent[1726]: 2025-11-01 00:11:43 INFO [HealthCheck] HealthCheck reporting agent health. Nov 1 00:11:45.628873 sshd_keygen[1722]: ssh-keygen: generating new host keys: RSA ECDSA ED25519 Nov 1 00:11:45.639286 amazon-ssm-agent[1726]: 2025-11-01 00:11:43 INFO [LongRunningPluginsManager] there aren't any long running plugin to execute Nov 1 00:11:45.667477 systemd[1]: Finished sshd-keygen.service. Nov 1 00:11:45.672677 systemd[1]: Starting issuegen.service... Nov 1 00:11:45.677230 systemd[1]: Started sshd@0-172.31.30.200:22-147.75.109.163:35256.service. Nov 1 00:11:45.689640 systemd[1]: issuegen.service: Deactivated successfully. Nov 1 00:11:45.690051 systemd[1]: Finished issuegen.service. Nov 1 00:11:45.694969 systemd[1]: Starting systemd-user-sessions.service... Nov 1 00:11:45.712212 systemd[1]: Finished systemd-user-sessions.service. Nov 1 00:11:45.717151 systemd[1]: Started getty@tty1.service. Nov 1 00:11:45.721880 systemd[1]: Started serial-getty@ttyS0.service. Nov 1 00:11:45.724297 systemd[1]: Reached target getty.target. Nov 1 00:11:45.737601 amazon-ssm-agent[1726]: 2025-11-01 00:11:43 INFO [LongRunningPluginsManager] There are no long running plugins currently getting executed - skipping their healthcheck Nov 1 00:11:45.836050 amazon-ssm-agent[1726]: 2025-11-01 00:11:43 INFO [MessageGatewayService] listening reply. Nov 1 00:11:45.934815 amazon-ssm-agent[1726]: 2025-11-01 00:11:43 INFO [StartupProcessor] Executing startup processor tasks Nov 1 00:11:45.940973 etcd-wrapper[2037]: v3.5.22: Pulling from coreos/etcd Nov 1 00:11:46.033882 amazon-ssm-agent[1726]: 2025-11-01 00:11:43 INFO [StartupProcessor] Write to serial port: Amazon SSM Agent v2.3.1319.0 is running Nov 1 00:11:46.037247 sshd[2053]: Accepted publickey for core from 147.75.109.163 port 35256 ssh2: RSA SHA256:l10clL99NTgBLZDdAUsIsAniCj4DES+0hQanxvSOioM Nov 1 00:11:46.043035 sshd[2053]: pam_unix(sshd:session): session opened for user core(uid=500) by (uid=0) Nov 1 00:11:46.065877 systemd[1]: Created slice user-500.slice. Nov 1 00:11:46.070925 systemd[1]: Starting user-runtime-dir@500.service... Nov 1 00:11:46.082014 systemd-logind[1712]: New session 1 of user core. Nov 1 00:11:46.094455 systemd[1]: Finished user-runtime-dir@500.service. Nov 1 00:11:46.101541 systemd[1]: Starting user@500.service... Nov 1 00:11:46.110112 (systemd)[2061]: pam_unix(systemd-user:session): session opened for user core(uid=500) by (uid=0) Nov 1 00:11:46.132927 amazon-ssm-agent[1726]: 2025-11-01 00:11:43 INFO [StartupProcessor] Write to serial port: OsProductName: Flatcar Container Linux by Kinvolk Nov 1 00:11:46.232182 amazon-ssm-agent[1726]: 2025-11-01 00:11:43 INFO [StartupProcessor] Write to serial port: OsVersion: 3510.3.8 Nov 1 00:11:46.301812 systemd[2061]: Queued start job for default target default.target. Nov 1 00:11:46.302874 systemd[2061]: Reached target paths.target. Nov 1 00:11:46.302926 systemd[2061]: Reached target sockets.target. Nov 1 00:11:46.302959 systemd[2061]: Reached target timers.target. Nov 1 00:11:46.302988 systemd[2061]: Reached target basic.target. Nov 1 00:11:46.303085 systemd[2061]: Reached target default.target. Nov 1 00:11:46.303151 systemd[2061]: Startup finished in 180ms. Nov 1 00:11:46.304143 systemd[1]: Started user@500.service. Nov 1 00:11:46.307951 systemd[1]: Started session-1.scope. Nov 1 00:11:46.321511 etcd-wrapper[2037]: 6c170d3e2c27: Pulling fs layer Nov 1 00:11:46.321511 etcd-wrapper[2037]: 2ae710cd8bfe: Pulling fs layer Nov 1 00:11:46.321511 etcd-wrapper[2037]: d462aa345367: Pulling fs layer Nov 1 00:11:46.321511 etcd-wrapper[2037]: 0f8b424aa0b9: Pulling fs layer Nov 1 00:11:46.321511 etcd-wrapper[2037]: d557676654e5: Pulling fs layer Nov 1 00:11:46.321511 etcd-wrapper[2037]: c8022d07192e: Pulling fs layer Nov 1 00:11:46.321511 etcd-wrapper[2037]: d858cbc252ad: Pulling fs layer Nov 1 00:11:46.321511 etcd-wrapper[2037]: 1069fc2daed1: Pulling fs layer Nov 1 00:11:46.321511 etcd-wrapper[2037]: b40161cd83fc: Pulling fs layer Nov 1 00:11:46.321511 etcd-wrapper[2037]: 5318d93a3a65: Pulling fs layer Nov 1 00:11:46.321511 etcd-wrapper[2037]: 307c1adadb60: Pulling fs layer Nov 1 00:11:46.321511 etcd-wrapper[2037]: 43e901b84b4f: Pulling fs layer Nov 1 00:11:46.321511 etcd-wrapper[2037]: e248ce7059b2: Pulling fs layer Nov 1 00:11:46.321511 etcd-wrapper[2037]: d9c3ebce7174: Pulling fs layer Nov 1 00:11:46.324609 etcd-wrapper[2037]: 1069fc2daed1: Waiting Nov 1 00:11:46.324609 etcd-wrapper[2037]: 0f8b424aa0b9: Waiting Nov 1 00:11:46.324609 etcd-wrapper[2037]: d557676654e5: Waiting Nov 1 00:11:46.324609 etcd-wrapper[2037]: c8022d07192e: Waiting Nov 1 00:11:46.324609 etcd-wrapper[2037]: d858cbc252ad: Waiting Nov 1 00:11:46.324609 etcd-wrapper[2037]: b40161cd83fc: Waiting Nov 1 00:11:46.324609 etcd-wrapper[2037]: 5318d93a3a65: Waiting Nov 1 00:11:46.324609 etcd-wrapper[2037]: 307c1adadb60: Waiting Nov 1 00:11:46.324609 etcd-wrapper[2037]: 43e901b84b4f: Waiting Nov 1 00:11:46.324609 etcd-wrapper[2037]: e248ce7059b2: Waiting Nov 1 00:11:46.324609 etcd-wrapper[2037]: d9c3ebce7174: Waiting Nov 1 00:11:46.332775 amazon-ssm-agent[1726]: 2025-11-01 00:11:43 INFO [MessageGatewayService] Opening websocket connection to: wss://ssmmessages.us-west-2.amazonaws.com/v1/control-channel/i-0977097823e8c0c7d?role=subscribe&stream=input Nov 1 00:11:46.431290 amazon-ssm-agent[1726]: 2025-11-01 00:11:43 INFO [MessageGatewayService] Successfully opened websocket connection to: wss://ssmmessages.us-west-2.amazonaws.com/v1/control-channel/i-0977097823e8c0c7d?role=subscribe&stream=input Nov 1 00:11:46.477041 systemd[1]: Started sshd@1-172.31.30.200:22-147.75.109.163:35260.service. Nov 1 00:11:46.531185 amazon-ssm-agent[1726]: 2025-11-01 00:11:43 INFO [MessageGatewayService] Starting receiving message from control channel Nov 1 00:11:46.631202 amazon-ssm-agent[1726]: 2025-11-01 00:11:43 INFO [MessageGatewayService] [EngineProcessor] Initial processing Nov 1 00:11:46.647213 etcd-wrapper[2037]: d462aa345367: Verifying Checksum Nov 1 00:11:46.647354 etcd-wrapper[2037]: d462aa345367: Download complete Nov 1 00:11:46.649258 etcd-wrapper[2037]: 2ae710cd8bfe: Verifying Checksum Nov 1 00:11:46.649385 etcd-wrapper[2037]: 2ae710cd8bfe: Download complete Nov 1 00:11:46.663835 sshd[2070]: Accepted publickey for core from 147.75.109.163 port 35260 ssh2: RSA SHA256:l10clL99NTgBLZDdAUsIsAniCj4DES+0hQanxvSOioM Nov 1 00:11:46.666524 sshd[2070]: pam_unix(sshd:session): session opened for user core(uid=500) by (uid=0) Nov 1 00:11:46.676248 systemd[1]: Started session-2.scope. Nov 1 00:11:46.678535 systemd-logind[1712]: New session 2 of user core. Nov 1 00:11:46.681848 etcd-wrapper[2037]: 6c170d3e2c27: Verifying Checksum Nov 1 00:11:46.682322 etcd-wrapper[2037]: 6c170d3e2c27: Download complete Nov 1 00:11:46.731463 amazon-ssm-agent[1726]: 2025-11-01 00:11:45 INFO [MessagingDeliveryService] [Association] No associations on boot. Requerying for associations after 30 seconds. Nov 1 00:11:46.808499 etcd-wrapper[2037]: 6c170d3e2c27: Pull complete Nov 1 00:11:46.832575 sshd[2070]: pam_unix(sshd:session): session closed for user core Nov 1 00:11:46.836487 systemd[1]: session-2.scope: Deactivated successfully. Nov 1 00:11:46.837615 systemd-logind[1712]: Session 2 logged out. Waiting for processes to exit. Nov 1 00:11:46.837968 systemd[1]: sshd@1-172.31.30.200:22-147.75.109.163:35260.service: Deactivated successfully. Nov 1 00:11:46.840294 systemd-logind[1712]: Removed session 2. Nov 1 00:11:46.859369 systemd[1]: Started sshd@2-172.31.30.200:22-147.75.109.163:35264.service. Nov 1 00:11:46.947737 systemd[1]: var-lib-docker-overlay2-a223a4b1b1b325372a6df5a733201dba090e17186df75461f1a51ebd157457b4-merged.mount: Deactivated successfully. Nov 1 00:11:46.951220 etcd-wrapper[2037]: d557676654e5: Verifying Checksum Nov 1 00:11:46.953454 etcd-wrapper[2037]: d557676654e5: Download complete Nov 1 00:11:46.980590 etcd-wrapper[2037]: 0f8b424aa0b9: Verifying Checksum Nov 1 00:11:46.980884 etcd-wrapper[2037]: 0f8b424aa0b9: Download complete Nov 1 00:11:46.990097 etcd-wrapper[2037]: c8022d07192e: Verifying Checksum Nov 1 00:11:46.990277 etcd-wrapper[2037]: c8022d07192e: Download complete Nov 1 00:11:46.990420 etcd-wrapper[2037]: 2ae710cd8bfe: Pull complete Nov 1 00:11:47.033149 sshd[2083]: Accepted publickey for core from 147.75.109.163 port 35264 ssh2: RSA SHA256:l10clL99NTgBLZDdAUsIsAniCj4DES+0hQanxvSOioM Nov 1 00:11:47.035895 sshd[2083]: pam_unix(sshd:session): session opened for user core(uid=500) by (uid=0) Nov 1 00:11:47.045997 systemd[1]: Started session-3.scope. Nov 1 00:11:47.050416 systemd-logind[1712]: New session 3 of user core. Nov 1 00:11:47.183225 sshd[2083]: pam_unix(sshd:session): session closed for user core Nov 1 00:11:47.188630 systemd[1]: session-3.scope: Deactivated successfully. Nov 1 00:11:47.189776 systemd-logind[1712]: Session 3 logged out. Waiting for processes to exit. Nov 1 00:11:47.190124 systemd[1]: sshd@2-172.31.30.200:22-147.75.109.163:35264.service: Deactivated successfully. Nov 1 00:11:47.192527 systemd-logind[1712]: Removed session 3. Nov 1 00:11:47.265650 etcd-wrapper[2037]: d858cbc252ad: Verifying Checksum Nov 1 00:11:47.265650 etcd-wrapper[2037]: d858cbc252ad: Download complete Nov 1 00:11:47.292764 etcd-wrapper[2037]: b40161cd83fc: Verifying Checksum Nov 1 00:11:47.293572 etcd-wrapper[2037]: b40161cd83fc: Download complete Nov 1 00:11:47.319408 etcd-wrapper[2037]: 1069fc2daed1: Verifying Checksum Nov 1 00:11:47.319408 etcd-wrapper[2037]: 1069fc2daed1: Download complete Nov 1 00:11:47.539437 systemd[1]: var-lib-docker-overlay2-42efce1a654dbc1492b13b772e95333f31e17ce256887dd1249d8ec70dbd4a8c-merged.mount: Deactivated successfully. Nov 1 00:11:47.577932 etcd-wrapper[2037]: 5318d93a3a65: Verifying Checksum Nov 1 00:11:47.578219 etcd-wrapper[2037]: 5318d93a3a65: Download complete Nov 1 00:11:47.651606 etcd-wrapper[2037]: d462aa345367: Pull complete Nov 1 00:11:47.728524 etcd-wrapper[2037]: 43e901b84b4f: Verifying Checksum Nov 1 00:11:47.728764 etcd-wrapper[2037]: 43e901b84b4f: Download complete Nov 1 00:11:47.760599 etcd-wrapper[2037]: 307c1adadb60: Verifying Checksum Nov 1 00:11:47.760810 etcd-wrapper[2037]: 307c1adadb60: Download complete Nov 1 00:11:47.778087 systemd[1]: var-lib-docker-overlay2-f22b22b5ab3a1a97de3e3a786951e101bf5351c8cd5c6030b066479f53b22b59-merged.mount: Deactivated successfully. Nov 1 00:11:47.813469 etcd-wrapper[2037]: 0f8b424aa0b9: Pull complete Nov 1 00:11:47.930043 systemd[1]: var-lib-docker-overlay2-64b149b7b2c7901dd95df301851844fbe1b9ec3e2c94460b6901951aeb4636e6-merged.mount: Deactivated successfully. Nov 1 00:11:47.967457 etcd-wrapper[2037]: d557676654e5: Pull complete Nov 1 00:11:47.980077 etcd-wrapper[2037]: e248ce7059b2: Verifying Checksum Nov 1 00:11:47.980077 etcd-wrapper[2037]: e248ce7059b2: Download complete Nov 1 00:11:48.098634 etcd-wrapper[2037]: c8022d07192e: Pull complete Nov 1 00:11:48.116978 etcd-wrapper[2037]: d9c3ebce7174: Verifying Checksum Nov 1 00:11:48.117176 etcd-wrapper[2037]: d9c3ebce7174: Download complete Nov 1 00:11:48.208416 etcd-wrapper[2037]: d858cbc252ad: Pull complete Nov 1 00:11:48.318549 etcd-wrapper[2037]: 1069fc2daed1: Pull complete Nov 1 00:11:48.411538 etcd-wrapper[2037]: b40161cd83fc: Pull complete Nov 1 00:11:48.526246 etcd-wrapper[2037]: 5318d93a3a65: Pull complete Nov 1 00:11:48.619719 systemd[1]: var-lib-docker-overlay2-7f55dd07f2187aa43e0de028f0ddcd3a8fd1df6f8c409cd6e2962674f75340fe-merged.mount: Deactivated successfully. Nov 1 00:11:48.645834 etcd-wrapper[2037]: 307c1adadb60: Pull complete Nov 1 00:11:49.180237 systemd[1]: var-lib-docker-overlay2-062d5edb48de0b60d5cbe313feb3b404b69e81a60a0d966d11b1ba53b2d1d534-merged.mount: Deactivated successfully. Nov 1 00:11:49.231885 etcd-wrapper[2037]: 43e901b84b4f: Pull complete Nov 1 00:11:49.659252 systemd[1]: var-lib-docker-overlay2-fc4c1b759c0d90363a7c1e825ee6aa9c0217d6c60c04b287d72984a2d0418bd1-merged.mount: Deactivated successfully. Nov 1 00:11:49.709732 etcd-wrapper[2037]: e248ce7059b2: Pull complete Nov 1 00:11:50.086321 systemd[1]: var-lib-docker-overlay2-b17201ec8e3603e76479c58821cb88ff94ec6ea090f7a1d04b90284dc091c111-merged.mount: Deactivated successfully. Nov 1 00:11:50.143248 etcd-wrapper[2037]: d9c3ebce7174: Pull complete Nov 1 00:11:50.162707 etcd-wrapper[2037]: Digest: sha256:51efcfc4f3a863c072ebe745942f790878c2a268e713a6d140c4f2593271adc6 Nov 1 00:11:50.169470 etcd-wrapper[2037]: Status: Downloaded newer image for quay.io/coreos/etcd:v3.5.22 Nov 1 00:11:50.186130 systemd[1]: var-lib-docker-overlay2-18b268d8f18456bc505ec24122cba821de8ff33719a62600bfbabe77da73fbed\x2dinit-merged.mount: Deactivated successfully. Nov 1 00:11:50.369838 env[1723]: time="2025-11-01T00:11:50.369629362Z" level=info msg="loading plugin \"io.containerd.event.v1.publisher\"..." runtime=io.containerd.runc.v2 type=io.containerd.event.v1 Nov 1 00:11:50.369838 env[1723]: time="2025-11-01T00:11:50.369765675Z" level=info msg="loading plugin \"io.containerd.internal.v1.shutdown\"..." runtime=io.containerd.runc.v2 type=io.containerd.internal.v1 Nov 1 00:11:50.370654 env[1723]: time="2025-11-01T00:11:50.370565852Z" level=info msg="loading plugin \"io.containerd.ttrpc.v1.task\"..." runtime=io.containerd.runc.v2 type=io.containerd.ttrpc.v1 Nov 1 00:11:50.371292 env[1723]: time="2025-11-01T00:11:50.371206097Z" level=info msg="starting signal loop" namespace=moby path=/run/containerd/io.containerd.runtime.v2.task/moby/9415a36bad1ef990108f2e9ed2ef4b8b498e86d9b7f6e072c3a553163f6a132c pid=2186 runtime=io.containerd.runc.v2 Nov 1 00:11:50.391602 systemd[1]: Started docker-9415a36bad1ef990108f2e9ed2ef4b8b498e86d9b7f6e072c3a553163f6a132c.scope. Nov 1 00:11:50.515399 etcd-wrapper[2037]: {"level":"info","ts":"2025-11-01T00:11:50.514831Z","caller":"flags/flag.go:113","msg":"recognized and used environment variable","variable-name":"ETCD_DATA_DIR","variable-value":"/var/lib/etcd"} Nov 1 00:11:50.515399 etcd-wrapper[2037]: {"level":"info","ts":"2025-11-01T00:11:50.515184Z","caller":"flags/flag.go:113","msg":"recognized and used environment variable","variable-name":"ETCD_NAME","variable-value":"ec2758cd78cdbc8de39d57f5436c1109"} Nov 1 00:11:50.516440 etcd-wrapper[2037]: {"level":"warn","ts":"2025-11-01T00:11:50.516116Z","caller":"flags/flag.go:93","msg":"unrecognized environment variable","environment-variable":"ETCD_IMAGE_URL=quay.io/coreos/etcd"} Nov 1 00:11:50.516440 etcd-wrapper[2037]: {"level":"warn","ts":"2025-11-01T00:11:50.516226Z","caller":"flags/flag.go:93","msg":"unrecognized environment variable","environment-variable":"ETCD_IMAGE_TAG=v3.5.22"} Nov 1 00:11:50.516440 etcd-wrapper[2037]: {"level":"warn","ts":"2025-11-01T00:11:50.516280Z","caller":"flags/flag.go:93","msg":"unrecognized environment variable","environment-variable":"ETCD_USER=etcd"} Nov 1 00:11:50.516948 etcd-wrapper[2037]: {"level":"warn","ts":"2025-11-01T00:11:50.516716Z","caller":"flags/flag.go:93","msg":"unrecognized environment variable","environment-variable":"ETCD_SSL_DIR=/etc/ssl/certs"} Nov 1 00:11:50.517329 etcd-wrapper[2037]: {"level":"warn","ts":"2025-11-01T00:11:50.517109Z","caller":"embed/config.go:689","msg":"Running http and grpc server on single port. This is not recommended for production."} Nov 1 00:11:50.517515 etcd-wrapper[2037]: {"level":"info","ts":"2025-11-01T00:11:50.517198Z","caller":"etcdmain/etcd.go:73","msg":"Running: ","args":["/usr/local/bin/etcd","--listen-client-urls=http://0.0.0.0:2379","--advertise-client-urls=http://172.31.30.200:2379"]} Nov 1 00:11:50.518019 etcd-wrapper[2037]: {"level":"warn","ts":"2025-11-01T00:11:50.517736Z","caller":"embed/config.go:689","msg":"Running http and grpc server on single port. This is not recommended for production."} Nov 1 00:11:50.518019 etcd-wrapper[2037]: {"level":"info","ts":"2025-11-01T00:11:50.517823Z","caller":"embed/etcd.go:140","msg":"configuring peer listeners","listen-peer-urls":["http://localhost:2380"]} Nov 1 00:11:50.519304 etcd-wrapper[2037]: {"level":"info","ts":"2025-11-01T00:11:50.518964Z","caller":"embed/etcd.go:148","msg":"configuring client listeners","listen-client-urls":["http://0.0.0.0:2379"]} Nov 1 00:11:50.519947 etcd-wrapper[2037]: {"level":"info","ts":"2025-11-01T00:11:50.519576Z","caller":"embed/etcd.go:323","msg":"starting an etcd server","etcd-version":"3.5.22","git-sha":"7862c85","go-version":"go1.23.11","go-os":"linux","go-arch":"arm64","max-cpu-set":2,"max-cpu-available":2,"member-initialized":false,"name":"ec2758cd78cdbc8de39d57f5436c1109","data-dir":"/var/lib/etcd","wal-dir":"","wal-dir-dedicated":"","member-dir":"/var/lib/etcd/member","force-new-cluster":false,"heartbeat-interval":"100ms","election-timeout":"1s","initial-election-tick-advance":true,"snapshot-count":100000,"max-wals":5,"max-snapshots":5,"snapshot-catchup-entries":5000,"initial-advertise-peer-urls":["http://localhost:2380"],"listen-peer-urls":["http://localhost:2380"],"advertise-client-urls":["http://172.31.30.200:2379"],"listen-client-urls":["http://0.0.0.0:2379"],"listen-metrics-urls":[],"cors":["*"],"host-whitelist":["*"],"initial-cluster":"ec2758cd78cdbc8de39d57f5436c1109=http://localhost:2380","initial-cluster-state":"new","initial-cluster-token":"etcd-cluster","quota-backend-bytes":2147483648,"max-request-bytes":1572864,"max-concurrent-streams":4294967295,"pre-vote":true,"initial-corrupt-check":false,"corrupt-check-time-interval":"0s","compact-check-time-enabled":false,"compact-check-time-interval":"1m0s","auto-compaction-mode":"periodic","auto-compaction-retention":"0s","auto-compaction-interval":"0s","discovery-url":"","discovery-proxy":"","downgrade-check-interval":"5s"} Nov 1 00:11:50.528096 etcd-wrapper[2037]: {"level":"info","ts":"2025-11-01T00:11:50.527741Z","caller":"etcdserver/backend.go:81","msg":"opened backend db","path":"/var/lib/etcd/member/snap/db","took":"7.226214ms"} Nov 1 00:11:50.538273 etcd-wrapper[2037]: {"level":"info","ts":"2025-11-01T00:11:50.537881Z","caller":"etcdserver/raft.go:507","msg":"starting local member","local-member-id":"8e9e05c52164694d","cluster-id":"cdf818194e3a8c32"} Nov 1 00:11:50.539018 etcd-wrapper[2037]: {"level":"info","ts":"2025-11-01T00:11:50.538673Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"8e9e05c52164694d switched to configuration voters=()"} Nov 1 00:11:50.539198 etcd-wrapper[2037]: {"level":"info","ts":"2025-11-01T00:11:50.538841Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"8e9e05c52164694d became follower at term 0"} Nov 1 00:11:50.539524 etcd-wrapper[2037]: {"level":"info","ts":"2025-11-01T00:11:50.538917Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"newRaft 8e9e05c52164694d [peers: [], term: 0, commit: 0, applied: 0, lastindex: 0, lastterm: 0]"} Nov 1 00:11:50.539707 etcd-wrapper[2037]: {"level":"info","ts":"2025-11-01T00:11:50.539381Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"8e9e05c52164694d became follower at term 1"} Nov 1 00:11:50.540104 etcd-wrapper[2037]: {"level":"info","ts":"2025-11-01T00:11:50.539855Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"8e9e05c52164694d switched to configuration voters=(10276657743932975437)"} Nov 1 00:11:50.547355 etcd-wrapper[2037]: {"level":"warn","ts":"2025-11-01T00:11:50.547009Z","caller":"auth/store.go:1241","msg":"simple token is not cryptographically signed"} Nov 1 00:11:50.550277 etcd-wrapper[2037]: {"level":"info","ts":"2025-11-01T00:11:50.549949Z","caller":"mvcc/kvstore.go:425","msg":"kvstore restored","current-rev":1} Nov 1 00:11:50.550466 etcd-wrapper[2037]: {"level":"info","ts":"2025-11-01T00:11:50.550094Z","caller":"etcdserver/server.go:628","msg":"restore consistentIndex","index":0} Nov 1 00:11:50.553591 etcd-wrapper[2037]: {"level":"info","ts":"2025-11-01T00:11:50.553275Z","caller":"etcdserver/quota.go:94","msg":"enabled backend quota with default value","quota-name":"v3-applier","quota-size-bytes":2147483648,"quota-size":"2.1 GB"} Nov 1 00:11:50.556075 etcd-wrapper[2037]: {"level":"info","ts":"2025-11-01T00:11:50.555770Z","caller":"etcdserver/server.go:875","msg":"starting etcd server","local-member-id":"8e9e05c52164694d","local-server-version":"3.5.22","cluster-version":"to_be_decided"} Nov 1 00:11:50.556926 etcd-wrapper[2037]: {"level":"info","ts":"2025-11-01T00:11:50.556606Z","caller":"v3rpc/health.go:61","msg":"grpc service status changed","service":"","status":"SERVING"} Nov 1 00:11:50.558008 etcd-wrapper[2037]: {"level":"info","ts":"2025-11-01T00:11:50.557656Z","caller":"etcdserver/server.go:759","msg":"started as single-node; fast-forwarding election ticks","local-member-id":"8e9e05c52164694d","forward-ticks":9,"forward-duration":"900ms","election-ticks":10,"election-timeout":"1s"} Nov 1 00:11:50.558431 etcd-wrapper[2037]: {"level":"info","ts":"2025-11-01T00:11:50.557907Z","caller":"fileutil/purge.go:50","msg":"started to purge file","dir":"/var/lib/etcd/member/snap","suffix":"snap.db","max":5,"interval":"30s"} Nov 1 00:11:50.558431 etcd-wrapper[2037]: {"level":"info","ts":"2025-11-01T00:11:50.558236Z","caller":"fileutil/purge.go:50","msg":"started to purge file","dir":"/var/lib/etcd/member/snap","suffix":"snap","max":5,"interval":"30s"} Nov 1 00:11:50.558665 etcd-wrapper[2037]: {"level":"info","ts":"2025-11-01T00:11:50.558291Z","caller":"fileutil/purge.go:50","msg":"started to purge file","dir":"/var/lib/etcd/member/wal","suffix":"wal","max":5,"interval":"30s"} Nov 1 00:11:50.559310 etcd-wrapper[2037]: {"level":"info","ts":"2025-11-01T00:11:50.559001Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"8e9e05c52164694d switched to configuration voters=(10276657743932975437)"} Nov 1 00:11:50.559884 etcd-wrapper[2037]: {"level":"info","ts":"2025-11-01T00:11:50.559205Z","caller":"membership/cluster.go:421","msg":"added member","cluster-id":"cdf818194e3a8c32","local-member-id":"8e9e05c52164694d","added-peer-id":"8e9e05c52164694d","added-peer-peer-urls":["http://localhost:2380"],"added-peer-is-learner":false} Nov 1 00:11:50.567127 etcd-wrapper[2037]: {"level":"info","ts":"2025-11-01T00:11:50.566725Z","caller":"embed/etcd.go:633","msg":"serving peer traffic","address":"127.0.0.1:2380"} Nov 1 00:11:50.567127 etcd-wrapper[2037]: {"level":"info","ts":"2025-11-01T00:11:50.566778Z","caller":"embed/etcd.go:603","msg":"cmux::serve","address":"127.0.0.1:2380"} Nov 1 00:11:50.567127 etcd-wrapper[2037]: {"level":"info","ts":"2025-11-01T00:11:50.566904Z","caller":"embed/etcd.go:292","msg":"now serving peer/client/metrics","local-member-id":"8e9e05c52164694d","initial-advertise-peer-urls":["http://localhost:2380"],"listen-peer-urls":["http://localhost:2380"],"advertise-client-urls":["http://172.31.30.200:2379"],"listen-client-urls":["http://0.0.0.0:2379"],"listen-metrics-urls":[]} Nov 1 00:11:51.441112 etcd-wrapper[2037]: {"level":"info","ts":"2025-11-01T00:11:51.440647Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"8e9e05c52164694d is starting a new election at term 1"} Nov 1 00:11:51.441112 etcd-wrapper[2037]: {"level":"info","ts":"2025-11-01T00:11:51.440800Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"8e9e05c52164694d became pre-candidate at term 1"} Nov 1 00:11:51.441442 etcd-wrapper[2037]: {"level":"info","ts":"2025-11-01T00:11:51.440908Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"8e9e05c52164694d received MsgPreVoteResp from 8e9e05c52164694d at term 1"} Nov 1 00:11:51.441442 etcd-wrapper[2037]: {"level":"info","ts":"2025-11-01T00:11:51.440967Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"8e9e05c52164694d became candidate at term 2"} Nov 1 00:11:51.442039 etcd-wrapper[2037]: {"level":"info","ts":"2025-11-01T00:11:51.441543Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"8e9e05c52164694d received MsgVoteResp from 8e9e05c52164694d at term 2"} Nov 1 00:11:51.442039 etcd-wrapper[2037]: {"level":"info","ts":"2025-11-01T00:11:51.441591Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"8e9e05c52164694d became leader at term 2"} Nov 1 00:11:51.442039 etcd-wrapper[2037]: {"level":"info","ts":"2025-11-01T00:11:51.441636Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"raft.node: 8e9e05c52164694d elected leader 8e9e05c52164694d at term 2"} Nov 1 00:11:51.444190 etcd-wrapper[2037]: {"level":"info","ts":"2025-11-01T00:11:51.443327Z","caller":"etcdserver/server.go:2144","msg":"published local member to cluster through raft","local-member-id":"8e9e05c52164694d","local-member-attributes":"{Name:ec2758cd78cdbc8de39d57f5436c1109 ClientURLs:[http://172.31.30.200:2379]}","request-path":"/0/members/8e9e05c52164694d/attributes","cluster-id":"cdf818194e3a8c32","publish-timeout":"7s"} Nov 1 00:11:51.444190 etcd-wrapper[2037]: {"level":"info","ts":"2025-11-01T00:11:51.443347Z","caller":"etcdserver/server.go:2697","msg":"setting up initial cluster version using v2 API","cluster-version":"3.5"} Nov 1 00:11:51.444190 etcd-wrapper[2037]: {"level":"info","ts":"2025-11-01T00:11:51.443546Z","caller":"embed/serve.go:124","msg":"ready to serve client requests"} Nov 1 00:11:51.444190 etcd-wrapper[2037]: {"level":"info","ts":"2025-11-01T00:11:51.443835Z","caller":"etcdmain/main.go:44","msg":"notifying init daemon"} Nov 1 00:11:51.444301 systemd[1]: Started etcd-member.service. Nov 1 00:11:51.444867 systemd[1]: Reached target multi-user.target. Nov 1 00:11:51.446312 etcd-wrapper[2037]: {"level":"info","ts":"2025-11-01T00:11:51.446001Z","caller":"membership/cluster.go:587","msg":"set initial cluster version","cluster-id":"cdf818194e3a8c32","local-member-id":"8e9e05c52164694d","cluster-version":"3.5"} Nov 1 00:11:51.446895 etcd-wrapper[2037]: {"level":"info","ts":"2025-11-01T00:11:51.446621Z","caller":"api/capability.go:75","msg":"enabled capabilities for version","cluster-version":"3.5"} Nov 1 00:11:51.447600 systemd[1]: Starting systemd-update-utmp-runlevel.service... Nov 1 00:11:51.451308 etcd-wrapper[2037]: {"level":"info","ts":"2025-11-01T00:11:51.449916Z","caller":"etcdserver/server.go:2721","msg":"cluster version is updated","cluster-version":"3.5"} Nov 1 00:11:51.451308 etcd-wrapper[2037]: {"level":"info","ts":"2025-11-01T00:11:51.448438Z","caller":"etcdmain/main.go:50","msg":"successfully notified init daemon"} Nov 1 00:11:51.451308 etcd-wrapper[2037]: {"level":"info","ts":"2025-11-01T00:11:51.449141Z","caller":"v3rpc/health.go:61","msg":"grpc service status changed","service":"","status":"SERVING"} Nov 1 00:11:51.452152 etcd-wrapper[2037]: {"level":"info","ts":"2025-11-01T00:11:51.451005Z","caller":"embed/serve.go:210","msg":"serving client traffic insecurely; this is strongly discouraged!","traffic":"grpc+http","address":"[::]:2379"} Nov 1 00:11:51.464190 systemd[1]: systemd-update-utmp-runlevel.service: Deactivated successfully. Nov 1 00:11:51.464623 systemd[1]: Finished systemd-update-utmp-runlevel.service. Nov 1 00:11:51.467784 systemd[1]: Startup finished in 1.263s (kernel) + 7.045s (initrd) + 17.818s (userspace) = 26.128s. Nov 1 00:11:57.252568 systemd[1]: Started sshd@3-172.31.30.200:22-147.75.109.163:37284.service. Nov 1 00:11:57.422563 sshd[2228]: Accepted publickey for core from 147.75.109.163 port 37284 ssh2: RSA SHA256:l10clL99NTgBLZDdAUsIsAniCj4DES+0hQanxvSOioM Nov 1 00:11:57.425585 sshd[2228]: pam_unix(sshd:session): session opened for user core(uid=500) by (uid=0) Nov 1 00:11:57.433923 systemd-logind[1712]: New session 4 of user core. Nov 1 00:11:57.434217 systemd[1]: Started session-4.scope. Nov 1 00:11:57.566570 sshd[2228]: pam_unix(sshd:session): session closed for user core Nov 1 00:11:57.571817 systemd-logind[1712]: Session 4 logged out. Waiting for processes to exit. Nov 1 00:11:57.572434 systemd[1]: sshd@3-172.31.30.200:22-147.75.109.163:37284.service: Deactivated successfully. Nov 1 00:11:57.573676 systemd[1]: session-4.scope: Deactivated successfully. Nov 1 00:11:57.575240 systemd-logind[1712]: Removed session 4. Nov 1 00:11:57.596097 systemd[1]: Started sshd@4-172.31.30.200:22-147.75.109.163:37288.service. Nov 1 00:11:57.762042 sshd[2234]: Accepted publickey for core from 147.75.109.163 port 37288 ssh2: RSA SHA256:l10clL99NTgBLZDdAUsIsAniCj4DES+0hQanxvSOioM Nov 1 00:11:57.764491 sshd[2234]: pam_unix(sshd:session): session opened for user core(uid=500) by (uid=0) Nov 1 00:11:57.772508 systemd-logind[1712]: New session 5 of user core. Nov 1 00:11:57.773405 systemd[1]: Started session-5.scope. Nov 1 00:11:57.894559 sshd[2234]: pam_unix(sshd:session): session closed for user core Nov 1 00:11:57.899378 systemd[1]: sshd@4-172.31.30.200:22-147.75.109.163:37288.service: Deactivated successfully. Nov 1 00:11:57.900660 systemd[1]: session-5.scope: Deactivated successfully. Nov 1 00:11:57.902077 systemd-logind[1712]: Session 5 logged out. Waiting for processes to exit. Nov 1 00:11:57.904277 systemd-logind[1712]: Removed session 5. Nov 1 00:11:57.922953 systemd[1]: Started sshd@5-172.31.30.200:22-147.75.109.163:37290.service. Nov 1 00:11:58.090745 sshd[2240]: Accepted publickey for core from 147.75.109.163 port 37290 ssh2: RSA SHA256:l10clL99NTgBLZDdAUsIsAniCj4DES+0hQanxvSOioM Nov 1 00:11:58.093776 sshd[2240]: pam_unix(sshd:session): session opened for user core(uid=500) by (uid=0) Nov 1 00:11:58.100772 systemd-logind[1712]: New session 6 of user core. Nov 1 00:11:58.102370 systemd[1]: Started session-6.scope. Nov 1 00:11:58.232567 sshd[2240]: pam_unix(sshd:session): session closed for user core Nov 1 00:11:58.237880 systemd-logind[1712]: Session 6 logged out. Waiting for processes to exit. Nov 1 00:11:58.238738 systemd[1]: sshd@5-172.31.30.200:22-147.75.109.163:37290.service: Deactivated successfully. Nov 1 00:11:58.239959 systemd[1]: session-6.scope: Deactivated successfully. Nov 1 00:11:58.241279 systemd-logind[1712]: Removed session 6. Nov 1 00:11:58.259914 systemd[1]: Started sshd@6-172.31.30.200:22-147.75.109.163:37294.service. Nov 1 00:11:58.426259 sshd[2246]: Accepted publickey for core from 147.75.109.163 port 37294 ssh2: RSA SHA256:l10clL99NTgBLZDdAUsIsAniCj4DES+0hQanxvSOioM Nov 1 00:11:58.429262 sshd[2246]: pam_unix(sshd:session): session opened for user core(uid=500) by (uid=0) Nov 1 00:11:58.437675 systemd[1]: Started session-7.scope. Nov 1 00:11:58.438633 systemd-logind[1712]: New session 7 of user core. Nov 1 00:11:58.613569 sudo[2249]: core : PWD=/home/core ; USER=root ; COMMAND=/usr/sbin/setenforce 1 Nov 1 00:11:58.614634 sudo[2249]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=500) Nov 1 00:11:58.627962 dbus-daemon[1706]: avc: received setenforce notice (enforcing=1) Nov 1 00:11:58.631427 sudo[2249]: pam_unix(sudo:session): session closed for user root Nov 1 00:11:58.656086 sshd[2246]: pam_unix(sshd:session): session closed for user core Nov 1 00:11:58.661584 systemd-logind[1712]: Session 7 logged out. Waiting for processes to exit. Nov 1 00:11:58.662309 systemd[1]: sshd@6-172.31.30.200:22-147.75.109.163:37294.service: Deactivated successfully. Nov 1 00:11:58.663571 systemd[1]: session-7.scope: Deactivated successfully. Nov 1 00:11:58.665261 systemd-logind[1712]: Removed session 7. Nov 1 00:11:58.683872 systemd[1]: Started sshd@7-172.31.30.200:22-147.75.109.163:37308.service. Nov 1 00:11:58.852069 sshd[2253]: Accepted publickey for core from 147.75.109.163 port 37308 ssh2: RSA SHA256:l10clL99NTgBLZDdAUsIsAniCj4DES+0hQanxvSOioM Nov 1 00:11:58.855152 sshd[2253]: pam_unix(sshd:session): session opened for user core(uid=500) by (uid=0) Nov 1 00:11:58.862675 systemd-logind[1712]: New session 8 of user core. Nov 1 00:11:58.863617 systemd[1]: Started session-8.scope. Nov 1 00:11:58.970146 sudo[2257]: core : PWD=/home/core ; USER=root ; COMMAND=/usr/bin/rm -rf /etc/audit/rules.d/80-selinux.rules /etc/audit/rules.d/99-default.rules Nov 1 00:11:58.971254 sudo[2257]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=500) Nov 1 00:11:58.976257 sudo[2257]: pam_unix(sudo:session): session closed for user root Nov 1 00:11:58.985493 sudo[2256]: core : PWD=/home/core ; USER=root ; COMMAND=/usr/bin/systemctl restart audit-rules Nov 1 00:11:58.986529 sudo[2256]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=500) Nov 1 00:11:59.003978 systemd[1]: Stopping audit-rules.service... Nov 1 00:11:59.004000 audit: CONFIG_CHANGE auid=4294967295 ses=4294967295 subj=system_u:system_r:kernel_t:s0 op=remove_rule key=(null) list=5 res=1 Nov 1 00:11:59.007982 kernel: kauditd_printk_skb: 73 callbacks suppressed Nov 1 00:11:59.008065 kernel: audit: type=1305 audit(1761955919.004:165): auid=4294967295 ses=4294967295 subj=system_u:system_r:kernel_t:s0 op=remove_rule key=(null) list=5 res=1 Nov 1 00:11:59.012056 auditctl[2260]: No rules Nov 1 00:11:59.004000 audit[2260]: SYSCALL arch=c00000b7 syscall=206 success=yes exit=1056 a0=3 a1=ffffe72ccb80 a2=420 a3=0 items=0 ppid=1 pid=2260 auid=4294967295 uid=0 gid=0 euid=0 suid=0 fsuid=0 egid=0 sgid=0 fsgid=0 tty=(none) ses=4294967295 comm="auditctl" exe="/usr/sbin/auditctl" subj=system_u:system_r:kernel_t:s0 key=(null) Nov 1 00:11:59.013026 systemd[1]: audit-rules.service: Deactivated successfully. Nov 1 00:11:59.013422 systemd[1]: Stopped audit-rules.service. Nov 1 00:11:59.024795 kernel: audit: type=1300 audit(1761955919.004:165): arch=c00000b7 syscall=206 success=yes exit=1056 a0=3 a1=ffffe72ccb80 a2=420 a3=0 items=0 ppid=1 pid=2260 auid=4294967295 uid=0 gid=0 euid=0 suid=0 fsuid=0 egid=0 sgid=0 fsgid=0 tty=(none) ses=4294967295 comm="auditctl" exe="/usr/sbin/auditctl" subj=system_u:system_r:kernel_t:s0 key=(null) Nov 1 00:11:59.026426 systemd[1]: Starting audit-rules.service... Nov 1 00:11:59.004000 audit: PROCTITLE proctitle=2F7362696E2F617564697463746C002D44 Nov 1 00:11:59.031884 kernel: audit: type=1327 audit(1761955919.004:165): proctitle=2F7362696E2F617564697463746C002D44 Nov 1 00:11:59.011000 audit[1]: SERVICE_STOP pid=1 uid=0 auid=4294967295 ses=4294967295 subj=system_u:system_r:kernel_t:s0 msg='unit=audit-rules comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Nov 1 00:11:59.040181 kernel: audit: type=1131 audit(1761955919.011:166): pid=1 uid=0 auid=4294967295 ses=4294967295 subj=system_u:system_r:kernel_t:s0 msg='unit=audit-rules comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Nov 1 00:11:59.062898 augenrules[2277]: No rules Nov 1 00:11:59.064497 systemd[1]: Finished audit-rules.service. Nov 1 00:11:59.063000 audit[1]: SERVICE_START pid=1 uid=0 auid=4294967295 ses=4294967295 subj=system_u:system_r:kernel_t:s0 msg='unit=audit-rules comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Nov 1 00:11:59.071005 sudo[2256]: pam_unix(sudo:session): session closed for user root Nov 1 00:11:59.069000 audit[2256]: USER_END pid=2256 uid=500 auid=500 ses=8 subj=system_u:system_r:kernel_t:s0 msg='op=PAM:session_close grantors=pam_limits,pam_env,pam_unix,pam_permit,pam_systemd acct="root" exe="/usr/bin/sudo" hostname=? addr=? terminal=? res=success' Nov 1 00:11:59.084127 kernel: audit: type=1130 audit(1761955919.063:167): pid=1 uid=0 auid=4294967295 ses=4294967295 subj=system_u:system_r:kernel_t:s0 msg='unit=audit-rules comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Nov 1 00:11:59.084236 kernel: audit: type=1106 audit(1761955919.069:168): pid=2256 uid=500 auid=500 ses=8 subj=system_u:system_r:kernel_t:s0 msg='op=PAM:session_close grantors=pam_limits,pam_env,pam_unix,pam_permit,pam_systemd acct="root" exe="/usr/bin/sudo" hostname=? addr=? terminal=? res=success' Nov 1 00:11:59.084298 kernel: audit: type=1104 audit(1761955919.069:169): pid=2256 uid=500 auid=500 ses=8 subj=system_u:system_r:kernel_t:s0 msg='op=PAM:setcred grantors=pam_env,pam_faillock,pam_unix acct="root" exe="/usr/bin/sudo" hostname=? addr=? terminal=? res=success' Nov 1 00:11:59.069000 audit[2256]: CRED_DISP pid=2256 uid=500 auid=500 ses=8 subj=system_u:system_r:kernel_t:s0 msg='op=PAM:setcred grantors=pam_env,pam_faillock,pam_unix acct="root" exe="/usr/bin/sudo" hostname=? addr=? terminal=? res=success' Nov 1 00:11:59.097992 sshd[2253]: pam_unix(sshd:session): session closed for user core Nov 1 00:11:59.098000 audit[2253]: USER_END pid=2253 uid=0 auid=500 ses=8 subj=system_u:system_r:kernel_t:s0 msg='op=PAM:session_close grantors=pam_loginuid,pam_env,pam_lastlog,pam_limits,pam_env,pam_unix,pam_permit,pam_systemd,pam_mail acct="core" exe="/usr/sbin/sshd" hostname=147.75.109.163 addr=147.75.109.163 terminal=ssh res=success' Nov 1 00:11:59.102271 systemd[1]: session-8.scope: Deactivated successfully. Nov 1 00:11:59.103381 systemd[1]: sshd@7-172.31.30.200:22-147.75.109.163:37308.service: Deactivated successfully. Nov 1 00:11:59.098000 audit[2253]: CRED_DISP pid=2253 uid=0 auid=500 ses=8 subj=system_u:system_r:kernel_t:s0 msg='op=PAM:setcred grantors=pam_env,pam_faillock,pam_unix acct="core" exe="/usr/sbin/sshd" hostname=147.75.109.163 addr=147.75.109.163 terminal=ssh res=success' Nov 1 00:11:59.123277 kernel: audit: type=1106 audit(1761955919.098:170): pid=2253 uid=0 auid=500 ses=8 subj=system_u:system_r:kernel_t:s0 msg='op=PAM:session_close grantors=pam_loginuid,pam_env,pam_lastlog,pam_limits,pam_env,pam_unix,pam_permit,pam_systemd,pam_mail acct="core" exe="/usr/sbin/sshd" hostname=147.75.109.163 addr=147.75.109.163 terminal=ssh res=success' Nov 1 00:11:59.123416 kernel: audit: type=1104 audit(1761955919.098:171): pid=2253 uid=0 auid=500 ses=8 subj=system_u:system_r:kernel_t:s0 msg='op=PAM:setcred grantors=pam_env,pam_faillock,pam_unix acct="core" exe="/usr/sbin/sshd" hostname=147.75.109.163 addr=147.75.109.163 terminal=ssh res=success' Nov 1 00:11:59.123483 systemd-logind[1712]: Session 8 logged out. Waiting for processes to exit. Nov 1 00:11:59.102000 audit[1]: SERVICE_STOP pid=1 uid=0 auid=4294967295 ses=4294967295 subj=system_u:system_r:kernel_t:s0 msg='unit=sshd@7-172.31.30.200:22-147.75.109.163:37308 comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Nov 1 00:11:59.135735 kernel: audit: type=1131 audit(1761955919.102:172): pid=1 uid=0 auid=4294967295 ses=4294967295 subj=system_u:system_r:kernel_t:s0 msg='unit=sshd@7-172.31.30.200:22-147.75.109.163:37308 comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Nov 1 00:11:59.131666 systemd[1]: Started sshd@8-172.31.30.200:22-147.75.109.163:37314.service. Nov 1 00:11:59.135000 audit[1]: SERVICE_START pid=1 uid=0 auid=4294967295 ses=4294967295 subj=system_u:system_r:kernel_t:s0 msg='unit=sshd@8-172.31.30.200:22-147.75.109.163:37314 comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Nov 1 00:11:59.138126 systemd-logind[1712]: Removed session 8. Nov 1 00:11:59.299000 audit[2283]: USER_ACCT pid=2283 uid=0 auid=4294967295 ses=4294967295 subj=system_u:system_r:kernel_t:s0 msg='op=PAM:accounting grantors=pam_access,pam_unix,pam_faillock,pam_permit acct="core" exe="/usr/sbin/sshd" hostname=147.75.109.163 addr=147.75.109.163 terminal=ssh res=success' Nov 1 00:11:59.300077 sshd[2283]: Accepted publickey for core from 147.75.109.163 port 37314 ssh2: RSA SHA256:l10clL99NTgBLZDdAUsIsAniCj4DES+0hQanxvSOioM Nov 1 00:11:59.301000 audit[2283]: CRED_ACQ pid=2283 uid=0 auid=4294967295 ses=4294967295 subj=system_u:system_r:kernel_t:s0 msg='op=PAM:setcred grantors=pam_env,pam_faillock,pam_unix acct="core" exe="/usr/sbin/sshd" hostname=147.75.109.163 addr=147.75.109.163 terminal=ssh res=success' Nov 1 00:11:59.301000 audit[2283]: SYSCALL arch=c00000b7 syscall=64 success=yes exit=3 a0=5 a1=fffff678cf40 a2=3 a3=1 items=0 ppid=1 pid=2283 auid=500 uid=0 gid=0 euid=0 suid=0 fsuid=0 egid=0 sgid=0 fsgid=0 tty=(none) ses=9 comm="sshd" exe="/usr/sbin/sshd" subj=system_u:system_r:kernel_t:s0 key=(null) Nov 1 00:11:59.301000 audit: PROCTITLE proctitle=737368643A20636F7265205B707269765D Nov 1 00:11:59.303008 sshd[2283]: pam_unix(sshd:session): session opened for user core(uid=500) by (uid=0) Nov 1 00:11:59.309781 systemd-logind[1712]: New session 9 of user core. Nov 1 00:11:59.311607 systemd[1]: Started session-9.scope. Nov 1 00:11:59.320000 audit[2283]: USER_START pid=2283 uid=0 auid=500 ses=9 subj=system_u:system_r:kernel_t:s0 msg='op=PAM:session_open grantors=pam_loginuid,pam_env,pam_lastlog,pam_limits,pam_env,pam_unix,pam_permit,pam_systemd,pam_mail acct="core" exe="/usr/sbin/sshd" hostname=147.75.109.163 addr=147.75.109.163 terminal=ssh res=success' Nov 1 00:11:59.322000 audit[2285]: CRED_ACQ pid=2285 uid=0 auid=500 ses=9 subj=system_u:system_r:kernel_t:s0 msg='op=PAM:setcred grantors=pam_env,pam_faillock,pam_unix acct="core" exe="/usr/sbin/sshd" hostname=147.75.109.163 addr=147.75.109.163 terminal=ssh res=success' Nov 1 00:11:59.433235 sshd[2283]: pam_unix(sshd:session): session closed for user core Nov 1 00:11:59.435000 audit[2283]: USER_END pid=2283 uid=0 auid=500 ses=9 subj=system_u:system_r:kernel_t:s0 msg='op=PAM:session_close grantors=pam_loginuid,pam_env,pam_lastlog,pam_limits,pam_env,pam_unix,pam_permit,pam_systemd,pam_mail acct="core" exe="/usr/sbin/sshd" hostname=147.75.109.163 addr=147.75.109.163 terminal=ssh res=success' Nov 1 00:11:59.436000 audit[2283]: CRED_DISP pid=2283 uid=0 auid=500 ses=9 subj=system_u:system_r:kernel_t:s0 msg='op=PAM:setcred grantors=pam_env,pam_faillock,pam_unix acct="core" exe="/usr/sbin/sshd" hostname=147.75.109.163 addr=147.75.109.163 terminal=ssh res=success' Nov 1 00:11:59.439302 systemd-logind[1712]: Session 9 logged out. Waiting for processes to exit. Nov 1 00:11:59.439000 audit[1]: SERVICE_STOP pid=1 uid=0 auid=4294967295 ses=4294967295 subj=system_u:system_r:kernel_t:s0 msg='unit=sshd@8-172.31.30.200:22-147.75.109.163:37314 comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Nov 1 00:11:59.439943 systemd[1]: sshd@8-172.31.30.200:22-147.75.109.163:37314.service: Deactivated successfully. Nov 1 00:11:59.441136 systemd[1]: session-9.scope: Deactivated successfully. Nov 1 00:11:59.442811 systemd-logind[1712]: Removed session 9. Nov 1 00:11:59.461868 systemd[1]: Started sshd@9-172.31.30.200:22-147.75.109.163:37326.service. Nov 1 00:11:59.461000 audit[1]: SERVICE_START pid=1 uid=0 auid=4294967295 ses=4294967295 subj=system_u:system_r:kernel_t:s0 msg='unit=sshd@9-172.31.30.200:22-147.75.109.163:37326 comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Nov 1 00:11:59.629000 audit[2291]: USER_ACCT pid=2291 uid=0 auid=4294967295 ses=4294967295 subj=system_u:system_r:kernel_t:s0 msg='op=PAM:accounting grantors=pam_access,pam_unix,pam_faillock,pam_permit acct="core" exe="/usr/sbin/sshd" hostname=147.75.109.163 addr=147.75.109.163 terminal=ssh res=success' Nov 1 00:11:59.630394 sshd[2291]: Accepted publickey for core from 147.75.109.163 port 37326 ssh2: RSA SHA256:l10clL99NTgBLZDdAUsIsAniCj4DES+0hQanxvSOioM Nov 1 00:11:59.631000 audit[2291]: CRED_ACQ pid=2291 uid=0 auid=4294967295 ses=4294967295 subj=system_u:system_r:kernel_t:s0 msg='op=PAM:setcred grantors=pam_env,pam_faillock,pam_unix acct="core" exe="/usr/sbin/sshd" hostname=147.75.109.163 addr=147.75.109.163 terminal=ssh res=success' Nov 1 00:11:59.631000 audit[2291]: SYSCALL arch=c00000b7 syscall=64 success=yes exit=3 a0=5 a1=ffffe7a60a20 a2=3 a3=1 items=0 ppid=1 pid=2291 auid=500 uid=0 gid=0 euid=0 suid=0 fsuid=0 egid=0 sgid=0 fsgid=0 tty=(none) ses=10 comm="sshd" exe="/usr/sbin/sshd" subj=system_u:system_r:kernel_t:s0 key=(null) Nov 1 00:11:59.631000 audit: PROCTITLE proctitle=737368643A20636F7265205B707269765D Nov 1 00:11:59.633038 sshd[2291]: pam_unix(sshd:session): session opened for user core(uid=500) by (uid=0) Nov 1 00:11:59.639774 systemd-logind[1712]: New session 10 of user core. Nov 1 00:11:59.641406 systemd[1]: Started session-10.scope. Nov 1 00:11:59.649000 audit[2291]: USER_START pid=2291 uid=0 auid=500 ses=10 subj=system_u:system_r:kernel_t:s0 msg='op=PAM:session_open grantors=pam_loginuid,pam_env,pam_lastlog,pam_limits,pam_env,pam_unix,pam_permit,pam_systemd,pam_mail acct="core" exe="/usr/sbin/sshd" hostname=147.75.109.163 addr=147.75.109.163 terminal=ssh res=success' Nov 1 00:11:59.652000 audit[2293]: CRED_ACQ pid=2293 uid=0 auid=500 ses=10 subj=system_u:system_r:kernel_t:s0 msg='op=PAM:setcred grantors=pam_env,pam_faillock,pam_unix acct="core" exe="/usr/sbin/sshd" hostname=147.75.109.163 addr=147.75.109.163 terminal=ssh res=success' Nov 1 00:11:59.950020 sshd[2291]: pam_unix(sshd:session): session closed for user core Nov 1 00:11:59.951000 audit[2291]: USER_END pid=2291 uid=0 auid=500 ses=10 subj=system_u:system_r:kernel_t:s0 msg='op=PAM:session_close grantors=pam_loginuid,pam_env,pam_lastlog,pam_limits,pam_env,pam_unix,pam_permit,pam_systemd,pam_mail acct="core" exe="/usr/sbin/sshd" hostname=147.75.109.163 addr=147.75.109.163 terminal=ssh res=success' Nov 1 00:11:59.951000 audit[2291]: CRED_DISP pid=2291 uid=0 auid=500 ses=10 subj=system_u:system_r:kernel_t:s0 msg='op=PAM:setcred grantors=pam_env,pam_faillock,pam_unix acct="core" exe="/usr/sbin/sshd" hostname=147.75.109.163 addr=147.75.109.163 terminal=ssh res=success' Nov 1 00:11:59.955287 systemd-logind[1712]: Session 10 logged out. Waiting for processes to exit. Nov 1 00:11:59.955775 systemd[1]: sshd@9-172.31.30.200:22-147.75.109.163:37326.service: Deactivated successfully. Nov 1 00:11:59.955000 audit[1]: SERVICE_STOP pid=1 uid=0 auid=4294967295 ses=4294967295 subj=system_u:system_r:kernel_t:s0 msg='unit=sshd@9-172.31.30.200:22-147.75.109.163:37326 comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Nov 1 00:11:59.957174 systemd[1]: session-10.scope: Deactivated successfully. Nov 1 00:11:59.958630 systemd-logind[1712]: Removed session 10. Nov 1 00:12:13.004308 systemd[1]: systemd-hostnamed.service: Deactivated successfully. Nov 1 00:12:13.004000 audit[1]: SERVICE_STOP pid=1 uid=0 auid=4294967295 ses=4294967295 subj=system_u:system_r:kernel_t:s0 msg='unit=systemd-hostnamed comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Nov 1 00:12:13.007712 kernel: kauditd_printk_skb: 22 callbacks suppressed Nov 1 00:12:13.007811 kernel: audit: type=1131 audit(1761955933.004:191): pid=1 uid=0 auid=4294967295 ses=4294967295 subj=system_u:system_r:kernel_t:s0 msg='unit=systemd-hostnamed comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Nov 1 00:12:13.036000 audit: BPF prog-id=34 op=UNLOAD Nov 1 00:12:13.036000 audit: BPF prog-id=33 op=UNLOAD Nov 1 00:12:13.042555 kernel: audit: type=1334 audit(1761955933.036:192): prog-id=34 op=UNLOAD Nov 1 00:12:13.042647 kernel: audit: type=1334 audit(1761955933.036:193): prog-id=33 op=UNLOAD Nov 1 00:12:13.036000 audit: BPF prog-id=32 op=UNLOAD Nov 1 00:12:13.045517 kernel: audit: type=1334 audit(1761955933.036:194): prog-id=32 op=UNLOAD Nov 1 00:12:15.627932 amazon-ssm-agent[1726]: 2025-11-01 00:12:15 INFO [MessagingDeliveryService] [Association] Schedule manager refreshed with 0 associations, 0 new associations associated Nov 1 00:12:27.350728 update_engine[1714]: I1101 00:12:27.350652 1714 update_attempter.cc:509] Updating boot flags... Nov 1 00:13:18.516326 amazon-ssm-agent[1726]: 2025-11-01 00:13:18 INFO [HealthCheck] HealthCheck reporting agent health.