Sep 12 17:44:23.926467 kernel: Linux version 6.6.106-flatcar (build@pony-truck.infra.kinvolk.io) (x86_64-cros-linux-gnu-gcc (Gentoo Hardened 13.3.1_p20240614 p17) 13.3.1 20240614, GNU ld (Gentoo 2.42 p3) 2.42.0) #1 SMP PREEMPT_DYNAMIC Fri Sep 12 16:05:08 -00 2025 Sep 12 17:44:23.926493 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=ttyS0,115200 flatcar.first_boot=detected verity.usrhash=1ff9ec556ac80c67ae2340139aa421bf26af13357ec9e72632b4878e9945dc9a Sep 12 17:44:23.926506 kernel: BIOS-provided physical RAM map: Sep 12 17:44:23.926514 kernel: BIOS-e820: [mem 0x0000000000000000-0x000000000009ffff] usable Sep 12 17:44:23.926522 kernel: BIOS-e820: [mem 0x0000000000100000-0x00000000007fffff] usable Sep 12 17:44:23.926529 kernel: BIOS-e820: [mem 0x0000000000800000-0x0000000000807fff] ACPI NVS Sep 12 17:44:23.926538 kernel: BIOS-e820: [mem 0x0000000000808000-0x000000000080afff] usable Sep 12 17:44:23.926546 kernel: BIOS-e820: [mem 0x000000000080b000-0x000000000080bfff] ACPI NVS Sep 12 17:44:23.926554 kernel: BIOS-e820: [mem 0x000000000080c000-0x000000000080ffff] usable Sep 12 17:44:23.926562 kernel: BIOS-e820: [mem 0x0000000000810000-0x00000000008fffff] ACPI NVS Sep 12 17:44:23.926573 kernel: BIOS-e820: [mem 0x0000000000900000-0x000000009c8eefff] usable Sep 12 17:44:23.926581 kernel: BIOS-e820: [mem 0x000000009c8ef000-0x000000009c9eefff] reserved Sep 12 17:44:23.926588 kernel: BIOS-e820: [mem 0x000000009c9ef000-0x000000009caeefff] type 20 Sep 12 17:44:23.926596 kernel: BIOS-e820: [mem 0x000000009caef000-0x000000009cb6efff] reserved Sep 12 17:44:23.926606 kernel: BIOS-e820: [mem 0x000000009cb6f000-0x000000009cb7efff] ACPI data Sep 12 17:44:23.926615 kernel: BIOS-e820: [mem 0x000000009cb7f000-0x000000009cbfefff] ACPI NVS Sep 12 17:44:23.926626 kernel: BIOS-e820: [mem 0x000000009cbff000-0x000000009cf3ffff] usable Sep 12 17:44:23.926635 kernel: BIOS-e820: [mem 0x000000009cf40000-0x000000009cf5ffff] reserved Sep 12 17:44:23.926643 kernel: BIOS-e820: [mem 0x000000009cf60000-0x000000009cffffff] ACPI NVS Sep 12 17:44:23.926651 kernel: BIOS-e820: [mem 0x00000000b0000000-0x00000000bfffffff] reserved Sep 12 17:44:23.926660 kernel: NX (Execute Disable) protection: active Sep 12 17:44:23.926668 kernel: APIC: Static calls initialized Sep 12 17:44:23.926676 kernel: efi: EFI v2.7 by EDK II Sep 12 17:44:23.926685 kernel: efi: SMBIOS=0x9c9ab000 ACPI=0x9cb7e000 ACPI 2.0=0x9cb7e014 MEMATTR=0x9b674118 Sep 12 17:44:23.926693 kernel: SMBIOS 2.8 present. Sep 12 17:44:23.926702 kernel: DMI: QEMU Standard PC (Q35 + ICH9, 2009), BIOS 0.0.0 02/06/2015 Sep 12 17:44:23.926710 kernel: Hypervisor detected: KVM Sep 12 17:44:23.926721 kernel: kvm-clock: Using msrs 4b564d01 and 4b564d00 Sep 12 17:44:23.926730 kernel: kvm-clock: using sched offset of 3931045117 cycles Sep 12 17:44:23.926739 kernel: clocksource: kvm-clock: mask: 0xffffffffffffffff max_cycles: 0x1cd42e4dffb, max_idle_ns: 881590591483 ns Sep 12 17:44:23.926748 kernel: tsc: Detected 2794.748 MHz processor Sep 12 17:44:23.926757 kernel: e820: update [mem 0x00000000-0x00000fff] usable ==> reserved Sep 12 17:44:23.926766 kernel: e820: remove [mem 0x000a0000-0x000fffff] usable Sep 12 17:44:23.926774 kernel: last_pfn = 0x9cf40 max_arch_pfn = 0x400000000 Sep 12 17:44:23.926783 kernel: MTRR map: 4 entries (2 fixed + 2 variable; max 18), built from 8 variable MTRRs Sep 12 17:44:23.926792 kernel: x86/PAT: Configuration [0-7]: WB WC UC- UC WB WP UC- WT Sep 12 17:44:23.926803 kernel: Using GB pages for direct mapping Sep 12 17:44:23.926812 kernel: Secure boot disabled Sep 12 17:44:23.926821 kernel: ACPI: Early table checksum verification disabled Sep 12 17:44:23.926830 kernel: ACPI: RSDP 0x000000009CB7E014 000024 (v02 BOCHS ) Sep 12 17:44:23.926842 kernel: ACPI: XSDT 0x000000009CB7D0E8 000054 (v01 BOCHS BXPC 00000001 01000013) Sep 12 17:44:23.926851 kernel: ACPI: FACP 0x000000009CB79000 0000F4 (v03 BOCHS BXPC 00000001 BXPC 00000001) Sep 12 17:44:23.926861 kernel: ACPI: DSDT 0x000000009CB7A000 0021BA (v01 BOCHS BXPC 00000001 BXPC 00000001) Sep 12 17:44:23.926872 kernel: ACPI: FACS 0x000000009CBDD000 000040 Sep 12 17:44:23.926881 kernel: ACPI: APIC 0x000000009CB78000 000090 (v01 BOCHS BXPC 00000001 BXPC 00000001) Sep 12 17:44:23.926891 kernel: ACPI: HPET 0x000000009CB77000 000038 (v01 BOCHS BXPC 00000001 BXPC 00000001) Sep 12 17:44:23.926900 kernel: ACPI: MCFG 0x000000009CB76000 00003C (v01 BOCHS BXPC 00000001 BXPC 00000001) Sep 12 17:44:23.926909 kernel: ACPI: WAET 0x000000009CB75000 000028 (v01 BOCHS BXPC 00000001 BXPC 00000001) Sep 12 17:44:23.926918 kernel: ACPI: BGRT 0x000000009CB74000 000038 (v01 INTEL EDK2 00000002 01000013) Sep 12 17:44:23.926927 kernel: ACPI: Reserving FACP table memory at [mem 0x9cb79000-0x9cb790f3] Sep 12 17:44:23.926939 kernel: ACPI: Reserving DSDT table memory at [mem 0x9cb7a000-0x9cb7c1b9] Sep 12 17:44:23.926948 kernel: ACPI: Reserving FACS table memory at [mem 0x9cbdd000-0x9cbdd03f] Sep 12 17:44:23.926957 kernel: ACPI: Reserving APIC table memory at [mem 0x9cb78000-0x9cb7808f] Sep 12 17:44:23.926966 kernel: ACPI: Reserving HPET table memory at [mem 0x9cb77000-0x9cb77037] Sep 12 17:44:23.926975 kernel: ACPI: Reserving MCFG table memory at [mem 0x9cb76000-0x9cb7603b] Sep 12 17:44:23.926984 kernel: ACPI: Reserving WAET table memory at [mem 0x9cb75000-0x9cb75027] Sep 12 17:44:23.926993 kernel: ACPI: Reserving BGRT table memory at [mem 0x9cb74000-0x9cb74037] Sep 12 17:44:23.927001 kernel: No NUMA configuration found Sep 12 17:44:23.927010 kernel: Faking a node at [mem 0x0000000000000000-0x000000009cf3ffff] Sep 12 17:44:23.927022 kernel: NODE_DATA(0) allocated [mem 0x9cea6000-0x9ceabfff] Sep 12 17:44:23.927031 kernel: Zone ranges: Sep 12 17:44:23.927040 kernel: DMA [mem 0x0000000000001000-0x0000000000ffffff] Sep 12 17:44:23.927059 kernel: DMA32 [mem 0x0000000001000000-0x000000009cf3ffff] Sep 12 17:44:23.927068 kernel: Normal empty Sep 12 17:44:23.927077 kernel: Movable zone start for each node Sep 12 17:44:23.927086 kernel: Early memory node ranges Sep 12 17:44:23.927095 kernel: node 0: [mem 0x0000000000001000-0x000000000009ffff] Sep 12 17:44:23.927104 kernel: node 0: [mem 0x0000000000100000-0x00000000007fffff] Sep 12 17:44:23.927113 kernel: node 0: [mem 0x0000000000808000-0x000000000080afff] Sep 12 17:44:23.927125 kernel: node 0: [mem 0x000000000080c000-0x000000000080ffff] Sep 12 17:44:23.927133 kernel: node 0: [mem 0x0000000000900000-0x000000009c8eefff] Sep 12 17:44:23.927142 kernel: node 0: [mem 0x000000009cbff000-0x000000009cf3ffff] Sep 12 17:44:23.927151 kernel: Initmem setup node 0 [mem 0x0000000000001000-0x000000009cf3ffff] Sep 12 17:44:23.927161 kernel: On node 0, zone DMA: 1 pages in unavailable ranges Sep 12 17:44:23.927170 kernel: On node 0, zone DMA: 96 pages in unavailable ranges Sep 12 17:44:23.927179 kernel: On node 0, zone DMA: 8 pages in unavailable ranges Sep 12 17:44:23.927188 kernel: On node 0, zone DMA: 1 pages in unavailable ranges Sep 12 17:44:23.927197 kernel: On node 0, zone DMA: 240 pages in unavailable ranges Sep 12 17:44:23.927208 kernel: On node 0, zone DMA32: 784 pages in unavailable ranges Sep 12 17:44:23.927217 kernel: On node 0, zone DMA32: 12480 pages in unavailable ranges Sep 12 17:44:23.927226 kernel: ACPI: PM-Timer IO Port: 0x608 Sep 12 17:44:23.927235 kernel: ACPI: LAPIC_NMI (acpi_id[0xff] dfl dfl lint[0x1]) Sep 12 17:44:23.927244 kernel: IOAPIC[0]: apic_id 0, version 17, address 0xfec00000, GSI 0-23 Sep 12 17:44:23.927253 kernel: ACPI: INT_SRC_OVR (bus 0 bus_irq 0 global_irq 2 dfl dfl) Sep 12 17:44:23.927262 kernel: ACPI: INT_SRC_OVR (bus 0 bus_irq 5 global_irq 5 high level) Sep 12 17:44:23.927272 kernel: ACPI: INT_SRC_OVR (bus 0 bus_irq 9 global_irq 9 high level) Sep 12 17:44:23.927281 kernel: ACPI: INT_SRC_OVR (bus 0 bus_irq 10 global_irq 10 high level) Sep 12 17:44:23.927290 kernel: ACPI: INT_SRC_OVR (bus 0 bus_irq 11 global_irq 11 high level) Sep 12 17:44:23.927301 kernel: ACPI: Using ACPI (MADT) for SMP configuration information Sep 12 17:44:23.927310 kernel: ACPI: HPET id: 0x8086a201 base: 0xfed00000 Sep 12 17:44:23.927319 kernel: TSC deadline timer available Sep 12 17:44:23.927328 kernel: smpboot: Allowing 4 CPUs, 0 hotplug CPUs Sep 12 17:44:23.927350 kernel: kvm-guest: APIC: eoi() replaced with kvm_guest_apic_eoi_write() Sep 12 17:44:23.927360 kernel: kvm-guest: KVM setup pv remote TLB flush Sep 12 17:44:23.927380 kernel: kvm-guest: setup PV sched yield Sep 12 17:44:23.927390 kernel: [mem 0xc0000000-0xffffffff] available for PCI devices Sep 12 17:44:23.927399 kernel: Booting paravirtualized kernel on KVM Sep 12 17:44:23.927428 kernel: clocksource: refined-jiffies: mask: 0xffffffff max_cycles: 0xffffffff, max_idle_ns: 1910969940391419 ns Sep 12 17:44:23.927438 kernel: setup_percpu: NR_CPUS:512 nr_cpumask_bits:4 nr_cpu_ids:4 nr_node_ids:1 Sep 12 17:44:23.927465 kernel: percpu: Embedded 58 pages/cpu s197160 r8192 d32216 u524288 Sep 12 17:44:23.927483 kernel: pcpu-alloc: s197160 r8192 d32216 u524288 alloc=1*2097152 Sep 12 17:44:23.927508 kernel: pcpu-alloc: [0] 0 1 2 3 Sep 12 17:44:23.927518 kernel: kvm-guest: PV spinlocks enabled Sep 12 17:44:23.927545 kernel: PV qspinlock hash table entries: 256 (order: 0, 4096 bytes, linear) Sep 12 17:44:23.927556 kernel: Kernel command line: rootflags=rw mount.usrflags=ro 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=ttyS0,115200 flatcar.first_boot=detected verity.usrhash=1ff9ec556ac80c67ae2340139aa421bf26af13357ec9e72632b4878e9945dc9a Sep 12 17:44:23.927586 kernel: Unknown kernel command line parameters "BOOT_IMAGE=/flatcar/vmlinuz-a", will be passed to user space. Sep 12 17:44:23.927595 kernel: random: crng init done Sep 12 17:44:23.927604 kernel: Dentry cache hash table entries: 524288 (order: 10, 4194304 bytes, linear) Sep 12 17:44:23.927614 kernel: Inode-cache hash table entries: 262144 (order: 9, 2097152 bytes, linear) Sep 12 17:44:23.927623 kernel: Fallback order for Node 0: 0 Sep 12 17:44:23.927632 kernel: Built 1 zonelists, mobility grouping on. Total pages: 629759 Sep 12 17:44:23.927641 kernel: Policy zone: DMA32 Sep 12 17:44:23.927650 kernel: mem auto-init: stack:off, heap alloc:off, heap free:off Sep 12 17:44:23.927659 kernel: Memory: 2395616K/2567000K available (12288K kernel code, 2293K rwdata, 22744K rodata, 42884K init, 2312K bss, 171124K reserved, 0K cma-reserved) Sep 12 17:44:23.927672 kernel: SLUB: HWalign=64, Order=0-3, MinObjects=0, CPUs=4, Nodes=1 Sep 12 17:44:23.927681 kernel: ftrace: allocating 37974 entries in 149 pages Sep 12 17:44:23.927690 kernel: ftrace: allocated 149 pages with 4 groups Sep 12 17:44:23.927699 kernel: Dynamic Preempt: voluntary Sep 12 17:44:23.927717 kernel: rcu: Preemptible hierarchical RCU implementation. Sep 12 17:44:23.927730 kernel: rcu: RCU event tracing is enabled. Sep 12 17:44:23.927739 kernel: rcu: RCU restricting CPUs from NR_CPUS=512 to nr_cpu_ids=4. Sep 12 17:44:23.927749 kernel: Trampoline variant of Tasks RCU enabled. Sep 12 17:44:23.927759 kernel: Rude variant of Tasks RCU enabled. Sep 12 17:44:23.927768 kernel: Tracing variant of Tasks RCU enabled. Sep 12 17:44:23.927778 kernel: rcu: RCU calculated value of scheduler-enlistment delay is 100 jiffies. Sep 12 17:44:23.927787 kernel: rcu: Adjusting geometry for rcu_fanout_leaf=16, nr_cpu_ids=4 Sep 12 17:44:23.927800 kernel: NR_IRQS: 33024, nr_irqs: 456, preallocated irqs: 16 Sep 12 17:44:23.927809 kernel: rcu: srcu_init: Setting srcu_struct sizes based on contention. Sep 12 17:44:23.927819 kernel: Console: colour dummy device 80x25 Sep 12 17:44:23.927828 kernel: printk: console [ttyS0] enabled Sep 12 17:44:23.927838 kernel: ACPI: Core revision 20230628 Sep 12 17:44:23.927850 kernel: clocksource: hpet: mask: 0xffffffff max_cycles: 0xffffffff, max_idle_ns: 19112604467 ns Sep 12 17:44:23.927860 kernel: APIC: Switch to symmetric I/O mode setup Sep 12 17:44:23.927869 kernel: x2apic enabled Sep 12 17:44:23.927879 kernel: APIC: Switched APIC routing to: physical x2apic Sep 12 17:44:23.927888 kernel: kvm-guest: APIC: send_IPI_mask() replaced with kvm_send_ipi_mask() Sep 12 17:44:23.927898 kernel: kvm-guest: APIC: send_IPI_mask_allbutself() replaced with kvm_send_ipi_mask_allbutself() Sep 12 17:44:23.927908 kernel: kvm-guest: setup PV IPIs Sep 12 17:44:23.927917 kernel: ..TIMER: vector=0x30 apic1=0 pin1=2 apic2=-1 pin2=-1 Sep 12 17:44:23.927927 kernel: tsc: Marking TSC unstable due to TSCs unsynchronized Sep 12 17:44:23.927939 kernel: Calibrating delay loop (skipped) preset value.. 5589.49 BogoMIPS (lpj=2794748) Sep 12 17:44:23.927949 kernel: x86/cpu: User Mode Instruction Prevention (UMIP) activated Sep 12 17:44:23.927958 kernel: Last level iTLB entries: 4KB 512, 2MB 255, 4MB 127 Sep 12 17:44:23.927968 kernel: Last level dTLB entries: 4KB 512, 2MB 255, 4MB 127, 1GB 0 Sep 12 17:44:23.927977 kernel: Spectre V1 : Mitigation: usercopy/swapgs barriers and __user pointer sanitization Sep 12 17:44:23.927987 kernel: Spectre V2 : Mitigation: Retpolines Sep 12 17:44:23.927996 kernel: Spectre V2 : Spectre v2 / SpectreRSB: Filling RSB on context switch and VMEXIT Sep 12 17:44:23.928006 kernel: Spectre V2 : Enabling Speculation Barrier for firmware calls Sep 12 17:44:23.928015 kernel: active return thunk: retbleed_return_thunk Sep 12 17:44:23.928028 kernel: RETBleed: Mitigation: untrained return thunk Sep 12 17:44:23.928037 kernel: Spectre V2 : mitigation: Enabling conditional Indirect Branch Prediction Barrier Sep 12 17:44:23.928057 kernel: Speculative Store Bypass: Mitigation: Speculative Store Bypass disabled via prctl Sep 12 17:44:23.928066 kernel: Speculative Return Stack Overflow: IBPB-extending microcode not applied! Sep 12 17:44:23.928077 kernel: Speculative Return Stack Overflow: WARNING: See https://kernel.org/doc/html/latest/admin-guide/hw-vuln/srso.html for mitigation options. Sep 12 17:44:23.928086 kernel: active return thunk: srso_return_thunk Sep 12 17:44:23.928096 kernel: Speculative Return Stack Overflow: Vulnerable: Safe RET, no microcode Sep 12 17:44:23.928105 kernel: x86/fpu: Supporting XSAVE feature 0x001: 'x87 floating point registers' Sep 12 17:44:23.928118 kernel: x86/fpu: Supporting XSAVE feature 0x002: 'SSE registers' Sep 12 17:44:23.928127 kernel: x86/fpu: Supporting XSAVE feature 0x004: 'AVX registers' Sep 12 17:44:23.928137 kernel: x86/fpu: xstate_offset[2]: 576, xstate_sizes[2]: 256 Sep 12 17:44:23.928147 kernel: x86/fpu: Enabled xstate features 0x7, context size is 832 bytes, using 'compacted' format. Sep 12 17:44:23.928156 kernel: Freeing SMP alternatives memory: 32K Sep 12 17:44:23.928166 kernel: pid_max: default: 32768 minimum: 301 Sep 12 17:44:23.928175 kernel: LSM: initializing lsm=lockdown,capability,landlock,selinux,integrity Sep 12 17:44:23.928185 kernel: landlock: Up and running. Sep 12 17:44:23.928194 kernel: SELinux: Initializing. Sep 12 17:44:23.928206 kernel: Mount-cache hash table entries: 8192 (order: 4, 65536 bytes, linear) Sep 12 17:44:23.928216 kernel: Mountpoint-cache hash table entries: 8192 (order: 4, 65536 bytes, linear) Sep 12 17:44:23.928225 kernel: smpboot: CPU0: AMD EPYC 7402P 24-Core Processor (family: 0x17, model: 0x31, stepping: 0x0) Sep 12 17:44:23.928235 kernel: RCU Tasks: Setting shift to 2 and lim to 1 rcu_task_cb_adjust=1 rcu_task_cpu_ids=4. Sep 12 17:44:23.928245 kernel: RCU Tasks Rude: Setting shift to 2 and lim to 1 rcu_task_cb_adjust=1 rcu_task_cpu_ids=4. Sep 12 17:44:23.928255 kernel: RCU Tasks Trace: Setting shift to 2 and lim to 1 rcu_task_cb_adjust=1 rcu_task_cpu_ids=4. Sep 12 17:44:23.928264 kernel: Performance Events: Fam17h+ core perfctr, AMD PMU driver. Sep 12 17:44:23.928274 kernel: ... version: 0 Sep 12 17:44:23.928283 kernel: ... bit width: 48 Sep 12 17:44:23.928295 kernel: ... generic registers: 6 Sep 12 17:44:23.928305 kernel: ... value mask: 0000ffffffffffff Sep 12 17:44:23.928314 kernel: ... max period: 00007fffffffffff Sep 12 17:44:23.928324 kernel: ... fixed-purpose events: 0 Sep 12 17:44:23.928333 kernel: ... event mask: 000000000000003f Sep 12 17:44:23.928366 kernel: signal: max sigframe size: 1776 Sep 12 17:44:23.928375 kernel: rcu: Hierarchical SRCU implementation. Sep 12 17:44:23.928385 kernel: rcu: Max phase no-delay instances is 400. Sep 12 17:44:23.928394 kernel: smp: Bringing up secondary CPUs ... Sep 12 17:44:23.928407 kernel: smpboot: x86: Booting SMP configuration: Sep 12 17:44:23.928416 kernel: .... node #0, CPUs: #1 #2 #3 Sep 12 17:44:23.928426 kernel: smp: Brought up 1 node, 4 CPUs Sep 12 17:44:23.928435 kernel: smpboot: Max logical packages: 1 Sep 12 17:44:23.928445 kernel: smpboot: Total of 4 processors activated (22357.98 BogoMIPS) Sep 12 17:44:23.928454 kernel: devtmpfs: initialized Sep 12 17:44:23.928464 kernel: x86/mm: Memory block size: 128MB Sep 12 17:44:23.928473 kernel: ACPI: PM: Registering ACPI NVS region [mem 0x00800000-0x00807fff] (32768 bytes) Sep 12 17:44:23.928483 kernel: ACPI: PM: Registering ACPI NVS region [mem 0x0080b000-0x0080bfff] (4096 bytes) Sep 12 17:44:23.928495 kernel: ACPI: PM: Registering ACPI NVS region [mem 0x00810000-0x008fffff] (983040 bytes) Sep 12 17:44:23.928505 kernel: ACPI: PM: Registering ACPI NVS region [mem 0x9cb7f000-0x9cbfefff] (524288 bytes) Sep 12 17:44:23.928514 kernel: ACPI: PM: Registering ACPI NVS region [mem 0x9cf60000-0x9cffffff] (655360 bytes) Sep 12 17:44:23.928524 kernel: clocksource: jiffies: mask: 0xffffffff max_cycles: 0xffffffff, max_idle_ns: 1911260446275000 ns Sep 12 17:44:23.928534 kernel: futex hash table entries: 1024 (order: 4, 65536 bytes, linear) Sep 12 17:44:23.928543 kernel: pinctrl core: initialized pinctrl subsystem Sep 12 17:44:23.928553 kernel: NET: Registered PF_NETLINK/PF_ROUTE protocol family Sep 12 17:44:23.928562 kernel: audit: initializing netlink subsys (disabled) Sep 12 17:44:23.928572 kernel: audit: type=2000 audit(1757699063.356:1): state=initialized audit_enabled=0 res=1 Sep 12 17:44:23.928584 kernel: thermal_sys: Registered thermal governor 'step_wise' Sep 12 17:44:23.928593 kernel: thermal_sys: Registered thermal governor 'user_space' Sep 12 17:44:23.928603 kernel: cpuidle: using governor menu Sep 12 17:44:23.928612 kernel: acpiphp: ACPI Hot Plug PCI Controller Driver version: 0.5 Sep 12 17:44:23.928622 kernel: dca service started, version 1.12.1 Sep 12 17:44:23.928631 kernel: PCI: MMCONFIG for domain 0000 [bus 00-ff] at [mem 0xb0000000-0xbfffffff] (base 0xb0000000) Sep 12 17:44:23.928641 kernel: PCI: MMCONFIG at [mem 0xb0000000-0xbfffffff] reserved as E820 entry Sep 12 17:44:23.928650 kernel: PCI: Using configuration type 1 for base access Sep 12 17:44:23.928660 kernel: kprobes: kprobe jump-optimization is enabled. All kprobes are optimized if possible. Sep 12 17:44:23.928672 kernel: HugeTLB: registered 1.00 GiB page size, pre-allocated 0 pages Sep 12 17:44:23.928682 kernel: HugeTLB: 16380 KiB vmemmap can be freed for a 1.00 GiB page Sep 12 17:44:23.928691 kernel: HugeTLB: registered 2.00 MiB page size, pre-allocated 0 pages Sep 12 17:44:23.928701 kernel: HugeTLB: 28 KiB vmemmap can be freed for a 2.00 MiB page Sep 12 17:44:23.928710 kernel: ACPI: Added _OSI(Module Device) Sep 12 17:44:23.928720 kernel: ACPI: Added _OSI(Processor Device) Sep 12 17:44:23.928729 kernel: ACPI: Added _OSI(Processor Aggregator Device) Sep 12 17:44:23.928738 kernel: ACPI: 1 ACPI AML tables successfully acquired and loaded Sep 12 17:44:23.928748 kernel: ACPI: _OSC evaluation for CPUs failed, trying _PDC Sep 12 17:44:23.928760 kernel: ACPI: Interpreter enabled Sep 12 17:44:23.928769 kernel: ACPI: PM: (supports S0 S3 S5) Sep 12 17:44:23.928779 kernel: ACPI: Using IOAPIC for interrupt routing Sep 12 17:44:23.928788 kernel: PCI: Using host bridge windows from ACPI; if necessary, use "pci=nocrs" and report a bug Sep 12 17:44:23.928798 kernel: PCI: Using E820 reservations for host bridge windows Sep 12 17:44:23.928807 kernel: ACPI: Enabled 2 GPEs in block 00 to 3F Sep 12 17:44:23.928817 kernel: ACPI: PCI Root Bridge [PCI0] (domain 0000 [bus 00-ff]) Sep 12 17:44:23.929147 kernel: acpi PNP0A08:00: _OSC: OS supports [ExtendedConfig ASPM ClockPM Segments MSI HPX-Type3] Sep 12 17:44:23.929369 kernel: acpi PNP0A08:00: _OSC: platform does not support [PCIeHotplug LTR] Sep 12 17:44:23.929533 kernel: acpi PNP0A08:00: _OSC: OS now controls [PME AER PCIeCapability] Sep 12 17:44:23.929546 kernel: PCI host bridge to bus 0000:00 Sep 12 17:44:23.929715 kernel: pci_bus 0000:00: root bus resource [io 0x0000-0x0cf7 window] Sep 12 17:44:23.929853 kernel: pci_bus 0000:00: root bus resource [io 0x0d00-0xffff window] Sep 12 17:44:23.929983 kernel: pci_bus 0000:00: root bus resource [mem 0x000a0000-0x000bffff window] Sep 12 17:44:23.930124 kernel: pci_bus 0000:00: root bus resource [mem 0x9d000000-0xafffffff window] Sep 12 17:44:23.930258 kernel: pci_bus 0000:00: root bus resource [mem 0xc0000000-0xfebfffff window] Sep 12 17:44:23.930429 kernel: pci_bus 0000:00: root bus resource [mem 0x800000000-0xfffffffff window] Sep 12 17:44:23.930555 kernel: pci_bus 0000:00: root bus resource [bus 00-ff] Sep 12 17:44:23.930712 kernel: pci 0000:00:00.0: [8086:29c0] type 00 class 0x060000 Sep 12 17:44:23.930863 kernel: pci 0000:00:01.0: [1234:1111] type 00 class 0x030000 Sep 12 17:44:23.931064 kernel: pci 0000:00:01.0: reg 0x10: [mem 0xc0000000-0xc0ffffff pref] Sep 12 17:44:23.931226 kernel: pci 0000:00:01.0: reg 0x18: [mem 0xc1044000-0xc1044fff] Sep 12 17:44:23.931389 kernel: pci 0000:00:01.0: reg 0x30: [mem 0xffff0000-0xffffffff pref] Sep 12 17:44:23.931533 kernel: pci 0000:00:01.0: BAR 0: assigned to efifb Sep 12 17:44:23.931679 kernel: pci 0000:00:01.0: Video device with shadowed ROM at [mem 0x000c0000-0x000dffff] Sep 12 17:44:23.931830 kernel: pci 0000:00:02.0: [1af4:1005] type 00 class 0x00ff00 Sep 12 17:44:23.931972 kernel: pci 0000:00:02.0: reg 0x10: [io 0x6100-0x611f] Sep 12 17:44:23.932169 kernel: pci 0000:00:02.0: reg 0x14: [mem 0xc1043000-0xc1043fff] Sep 12 17:44:23.932326 kernel: pci 0000:00:02.0: reg 0x20: [mem 0x800000000-0x800003fff 64bit pref] Sep 12 17:44:23.932493 kernel: pci 0000:00:03.0: [1af4:1001] type 00 class 0x010000 Sep 12 17:44:23.932635 kernel: pci 0000:00:03.0: reg 0x10: [io 0x6000-0x607f] Sep 12 17:44:23.932777 kernel: pci 0000:00:03.0: reg 0x14: [mem 0xc1042000-0xc1042fff] Sep 12 17:44:23.932917 kernel: pci 0000:00:03.0: reg 0x20: [mem 0x800004000-0x800007fff 64bit pref] Sep 12 17:44:23.933085 kernel: pci 0000:00:04.0: [1af4:1000] type 00 class 0x020000 Sep 12 17:44:23.933227 kernel: pci 0000:00:04.0: reg 0x10: [io 0x60e0-0x60ff] Sep 12 17:44:23.933396 kernel: pci 0000:00:04.0: reg 0x14: [mem 0xc1041000-0xc1041fff] Sep 12 17:44:23.933535 kernel: pci 0000:00:04.0: reg 0x20: [mem 0x800008000-0x80000bfff 64bit pref] Sep 12 17:44:23.933673 kernel: pci 0000:00:04.0: reg 0x30: [mem 0xfffc0000-0xffffffff pref] Sep 12 17:44:23.933822 kernel: pci 0000:00:1f.0: [8086:2918] type 00 class 0x060100 Sep 12 17:44:23.933962 kernel: pci 0000:00:1f.0: quirk: [io 0x0600-0x067f] claimed by ICH6 ACPI/GPIO/TCO Sep 12 17:44:23.934124 kernel: pci 0000:00:1f.2: [8086:2922] type 00 class 0x010601 Sep 12 17:44:23.934273 kernel: pci 0000:00:1f.2: reg 0x20: [io 0x60c0-0x60df] Sep 12 17:44:23.934442 kernel: pci 0000:00:1f.2: reg 0x24: [mem 0xc1040000-0xc1040fff] Sep 12 17:44:23.934591 kernel: pci 0000:00:1f.3: [8086:2930] type 00 class 0x0c0500 Sep 12 17:44:23.934730 kernel: pci 0000:00:1f.3: reg 0x20: [io 0x6080-0x60bf] Sep 12 17:44:23.934743 kernel: ACPI: PCI: Interrupt link LNKA configured for IRQ 10 Sep 12 17:44:23.934753 kernel: ACPI: PCI: Interrupt link LNKB configured for IRQ 10 Sep 12 17:44:23.934762 kernel: ACPI: PCI: Interrupt link LNKC configured for IRQ 11 Sep 12 17:44:23.934772 kernel: ACPI: PCI: Interrupt link LNKD configured for IRQ 11 Sep 12 17:44:23.934786 kernel: ACPI: PCI: Interrupt link LNKE configured for IRQ 10 Sep 12 17:44:23.934795 kernel: ACPI: PCI: Interrupt link LNKF configured for IRQ 10 Sep 12 17:44:23.934805 kernel: ACPI: PCI: Interrupt link LNKG configured for IRQ 11 Sep 12 17:44:23.934815 kernel: ACPI: PCI: Interrupt link LNKH configured for IRQ 11 Sep 12 17:44:23.934824 kernel: ACPI: PCI: Interrupt link GSIA configured for IRQ 16 Sep 12 17:44:23.934834 kernel: ACPI: PCI: Interrupt link GSIB configured for IRQ 17 Sep 12 17:44:23.934843 kernel: ACPI: PCI: Interrupt link GSIC configured for IRQ 18 Sep 12 17:44:23.934853 kernel: ACPI: PCI: Interrupt link GSID configured for IRQ 19 Sep 12 17:44:23.934863 kernel: ACPI: PCI: Interrupt link GSIE configured for IRQ 20 Sep 12 17:44:23.934875 kernel: ACPI: PCI: Interrupt link GSIF configured for IRQ 21 Sep 12 17:44:23.934884 kernel: ACPI: PCI: Interrupt link GSIG configured for IRQ 22 Sep 12 17:44:23.934894 kernel: ACPI: PCI: Interrupt link GSIH configured for IRQ 23 Sep 12 17:44:23.934903 kernel: iommu: Default domain type: Translated Sep 12 17:44:23.934913 kernel: iommu: DMA domain TLB invalidation policy: lazy mode Sep 12 17:44:23.934922 kernel: efivars: Registered efivars operations Sep 12 17:44:23.934932 kernel: PCI: Using ACPI for IRQ routing Sep 12 17:44:23.934942 kernel: PCI: pci_cache_line_size set to 64 bytes Sep 12 17:44:23.934952 kernel: e820: reserve RAM buffer [mem 0x0080b000-0x008fffff] Sep 12 17:44:23.934964 kernel: e820: reserve RAM buffer [mem 0x00810000-0x008fffff] Sep 12 17:44:23.934973 kernel: e820: reserve RAM buffer [mem 0x9c8ef000-0x9fffffff] Sep 12 17:44:23.934983 kernel: e820: reserve RAM buffer [mem 0x9cf40000-0x9fffffff] Sep 12 17:44:23.935138 kernel: pci 0000:00:01.0: vgaarb: setting as boot VGA device Sep 12 17:44:23.935278 kernel: pci 0000:00:01.0: vgaarb: bridge control possible Sep 12 17:44:23.935485 kernel: pci 0000:00:01.0: vgaarb: VGA device added: decodes=io+mem,owns=io+mem,locks=none Sep 12 17:44:23.935499 kernel: vgaarb: loaded Sep 12 17:44:23.935509 kernel: hpet0: at MMIO 0xfed00000, IRQs 2, 8, 0 Sep 12 17:44:23.935518 kernel: hpet0: 3 comparators, 64-bit 100.000000 MHz counter Sep 12 17:44:23.935533 kernel: clocksource: Switched to clocksource kvm-clock Sep 12 17:44:23.935542 kernel: VFS: Disk quotas dquot_6.6.0 Sep 12 17:44:23.935552 kernel: VFS: Dquot-cache hash table entries: 512 (order 0, 4096 bytes) Sep 12 17:44:23.935562 kernel: pnp: PnP ACPI init Sep 12 17:44:23.935709 kernel: system 00:05: [mem 0xb0000000-0xbfffffff window] has been reserved Sep 12 17:44:23.935723 kernel: pnp: PnP ACPI: found 6 devices Sep 12 17:44:23.935733 kernel: clocksource: acpi_pm: mask: 0xffffff max_cycles: 0xffffff, max_idle_ns: 2085701024 ns Sep 12 17:44:23.935742 kernel: NET: Registered PF_INET protocol family Sep 12 17:44:23.935755 kernel: IP idents hash table entries: 65536 (order: 7, 524288 bytes, linear) Sep 12 17:44:23.935765 kernel: tcp_listen_portaddr_hash hash table entries: 2048 (order: 3, 32768 bytes, linear) Sep 12 17:44:23.935775 kernel: Table-perturb hash table entries: 65536 (order: 6, 262144 bytes, linear) Sep 12 17:44:23.935785 kernel: TCP established hash table entries: 32768 (order: 6, 262144 bytes, linear) Sep 12 17:44:23.935794 kernel: TCP bind hash table entries: 32768 (order: 8, 1048576 bytes, linear) Sep 12 17:44:23.935804 kernel: TCP: Hash tables configured (established 32768 bind 32768) Sep 12 17:44:23.935814 kernel: UDP hash table entries: 2048 (order: 4, 65536 bytes, linear) Sep 12 17:44:23.935823 kernel: UDP-Lite hash table entries: 2048 (order: 4, 65536 bytes, linear) Sep 12 17:44:23.935833 kernel: NET: Registered PF_UNIX/PF_LOCAL protocol family Sep 12 17:44:23.935845 kernel: NET: Registered PF_XDP protocol family Sep 12 17:44:23.935982 kernel: pci 0000:00:04.0: can't claim BAR 6 [mem 0xfffc0000-0xffffffff pref]: no compatible bridge window Sep 12 17:44:23.936132 kernel: pci 0000:00:04.0: BAR 6: assigned [mem 0x9d000000-0x9d03ffff pref] Sep 12 17:44:23.936260 kernel: pci_bus 0000:00: resource 4 [io 0x0000-0x0cf7 window] Sep 12 17:44:23.936410 kernel: pci_bus 0000:00: resource 5 [io 0x0d00-0xffff window] Sep 12 17:44:23.936538 kernel: pci_bus 0000:00: resource 6 [mem 0x000a0000-0x000bffff window] Sep 12 17:44:23.936665 kernel: pci_bus 0000:00: resource 7 [mem 0x9d000000-0xafffffff window] Sep 12 17:44:23.936798 kernel: pci_bus 0000:00: resource 8 [mem 0xc0000000-0xfebfffff window] Sep 12 17:44:23.936927 kernel: pci_bus 0000:00: resource 9 [mem 0x800000000-0xfffffffff window] Sep 12 17:44:23.936939 kernel: PCI: CLS 0 bytes, default 64 Sep 12 17:44:23.936949 kernel: Initialise system trusted keyrings Sep 12 17:44:23.936959 kernel: workingset: timestamp_bits=39 max_order=20 bucket_order=0 Sep 12 17:44:23.936968 kernel: Key type asymmetric registered Sep 12 17:44:23.936978 kernel: Asymmetric key parser 'x509' registered Sep 12 17:44:23.936987 kernel: Block layer SCSI generic (bsg) driver version 0.4 loaded (major 251) Sep 12 17:44:23.936997 kernel: io scheduler mq-deadline registered Sep 12 17:44:23.937010 kernel: io scheduler kyber registered Sep 12 17:44:23.937020 kernel: io scheduler bfq registered Sep 12 17:44:23.937029 kernel: ioatdma: Intel(R) QuickData Technology Driver 5.00 Sep 12 17:44:23.937039 kernel: ACPI: \_SB_.GSIG: Enabled at IRQ 22 Sep 12 17:44:23.937060 kernel: ACPI: \_SB_.GSIH: Enabled at IRQ 23 Sep 12 17:44:23.937070 kernel: ACPI: \_SB_.GSIE: Enabled at IRQ 20 Sep 12 17:44:23.937080 kernel: Serial: 8250/16550 driver, 4 ports, IRQ sharing enabled Sep 12 17:44:23.937089 kernel: 00:03: ttyS0 at I/O 0x3f8 (irq = 4, base_baud = 115200) is a 16550A Sep 12 17:44:23.937099 kernel: i8042: PNP: PS/2 Controller [PNP0303:KBD,PNP0f13:MOU] at 0x60,0x64 irq 1,12 Sep 12 17:44:23.937112 kernel: serio: i8042 KBD port at 0x60,0x64 irq 1 Sep 12 17:44:23.937122 kernel: serio: i8042 AUX port at 0x60,0x64 irq 12 Sep 12 17:44:23.937267 kernel: rtc_cmos 00:04: RTC can wake from S4 Sep 12 17:44:23.937281 kernel: input: AT Translated Set 2 keyboard as /devices/platform/i8042/serio0/input/input0 Sep 12 17:44:23.937426 kernel: rtc_cmos 00:04: registered as rtc0 Sep 12 17:44:23.937556 kernel: rtc_cmos 00:04: setting system clock to 2025-09-12T17:44:23 UTC (1757699063) Sep 12 17:44:23.937687 kernel: rtc_cmos 00:04: alarms up to one day, y3k, 242 bytes nvram, hpet irqs Sep 12 17:44:23.937699 kernel: amd_pstate: the _CPC object is not present in SBIOS or ACPI disabled Sep 12 17:44:23.937713 kernel: efifb: probing for efifb Sep 12 17:44:23.937722 kernel: efifb: framebuffer at 0xc0000000, using 1408k, total 1408k Sep 12 17:44:23.937732 kernel: efifb: mode is 800x600x24, linelength=2400, pages=1 Sep 12 17:44:23.937742 kernel: efifb: scrolling: redraw Sep 12 17:44:23.937751 kernel: efifb: Truecolor: size=0:8:8:8, shift=0:16:8:0 Sep 12 17:44:23.937761 kernel: Console: switching to colour frame buffer device 100x37 Sep 12 17:44:23.937792 kernel: fb0: EFI VGA frame buffer device Sep 12 17:44:23.937804 kernel: pstore: Using crash dump compression: deflate Sep 12 17:44:23.937814 kernel: pstore: Registered efi_pstore as persistent store backend Sep 12 17:44:23.937827 kernel: NET: Registered PF_INET6 protocol family Sep 12 17:44:23.937837 kernel: Segment Routing with IPv6 Sep 12 17:44:23.937847 kernel: In-situ OAM (IOAM) with IPv6 Sep 12 17:44:23.937857 kernel: NET: Registered PF_PACKET protocol family Sep 12 17:44:23.937866 kernel: Key type dns_resolver registered Sep 12 17:44:23.937876 kernel: IPI shorthand broadcast: enabled Sep 12 17:44:23.937886 kernel: sched_clock: Marking stable (663003477, 112525901)->(797277424, -21748046) Sep 12 17:44:23.937896 kernel: registered taskstats version 1 Sep 12 17:44:23.937906 kernel: Loading compiled-in X.509 certificates Sep 12 17:44:23.937919 kernel: Loaded X.509 cert 'Kinvolk GmbH: Module signing key for 6.6.106-flatcar: 449ba23cbe21e08b3bddb674b4885682335ee1f9' Sep 12 17:44:23.937929 kernel: Key type .fscrypt registered Sep 12 17:44:23.937939 kernel: Key type fscrypt-provisioning registered Sep 12 17:44:23.937949 kernel: ima: No TPM chip found, activating TPM-bypass! Sep 12 17:44:23.937959 kernel: ima: Allocated hash algorithm: sha1 Sep 12 17:44:23.937968 kernel: ima: No architecture policies found Sep 12 17:44:23.937978 kernel: clk: Disabling unused clocks Sep 12 17:44:23.937988 kernel: Freeing unused kernel image (initmem) memory: 42884K Sep 12 17:44:23.937998 kernel: Write protecting the kernel read-only data: 36864k Sep 12 17:44:23.938011 kernel: Freeing unused kernel image (rodata/data gap) memory: 1832K Sep 12 17:44:23.938023 kernel: Run /init as init process Sep 12 17:44:23.938033 kernel: with arguments: Sep 12 17:44:23.938055 kernel: /init Sep 12 17:44:23.938065 kernel: with environment: Sep 12 17:44:23.938075 kernel: HOME=/ Sep 12 17:44:23.938085 kernel: TERM=linux Sep 12 17:44:23.938095 kernel: BOOT_IMAGE=/flatcar/vmlinuz-a Sep 12 17:44:23.938107 systemd[1]: systemd 255 running in system mode (+PAM +AUDIT +SELINUX -APPARMOR +IMA +SMACK +SECCOMP +GCRYPT -GNUTLS +OPENSSL -ACL +BLKID +CURL +ELFUTILS -FIDO2 +IDN2 -IDN +IPTC +KMOD +LIBCRYPTSETUP +LIBFDISK +PCRE2 -PWQUALITY -P11KIT -QRENCODE +TPM2 +BZIP2 +LZ4 +XZ +ZLIB +ZSTD -BPF_FRAMEWORK -XKBCOMMON +UTMP -SYSVINIT default-hierarchy=unified) Sep 12 17:44:23.938123 systemd[1]: Detected virtualization kvm. Sep 12 17:44:23.938133 systemd[1]: Detected architecture x86-64. Sep 12 17:44:23.938144 systemd[1]: Running in initrd. Sep 12 17:44:23.938157 systemd[1]: No hostname configured, using default hostname. Sep 12 17:44:23.938169 systemd[1]: Hostname set to . Sep 12 17:44:23.938180 systemd[1]: Initializing machine ID from VM UUID. Sep 12 17:44:23.938191 systemd[1]: Queued start job for default target initrd.target. Sep 12 17:44:23.938202 systemd[1]: Started clevis-luks-askpass.path - Forward Password Requests to Clevis Directory Watch. Sep 12 17:44:23.938212 systemd[1]: Started systemd-ask-password-console.path - Dispatch Password Requests to Console Directory Watch. Sep 12 17:44:23.938224 systemd[1]: Expecting device dev-disk-by\x2dlabel-EFI\x2dSYSTEM.device - /dev/disk/by-label/EFI-SYSTEM... Sep 12 17:44:23.938235 systemd[1]: Expecting device dev-disk-by\x2dlabel-OEM.device - /dev/disk/by-label/OEM... Sep 12 17:44:23.938251 systemd[1]: Expecting device dev-disk-by\x2dlabel-ROOT.device - /dev/disk/by-label/ROOT... Sep 12 17:44:23.938264 systemd[1]: Expecting device dev-disk-by\x2dpartlabel-USR\x2dA.device - /dev/disk/by-partlabel/USR-A... Sep 12 17:44:23.938277 systemd[1]: Expecting device dev-disk-by\x2dpartuuid-7130c94a\x2d213a\x2d4e5a\x2d8e26\x2d6cce9662f132.device - /dev/disk/by-partuuid/7130c94a-213a-4e5a-8e26-6cce9662f132... Sep 12 17:44:23.938288 systemd[1]: Expecting device dev-mapper-usr.device - /dev/mapper/usr... Sep 12 17:44:23.938299 systemd[1]: Reached target cryptsetup-pre.target - Local Encrypted Volumes (Pre). Sep 12 17:44:23.938310 systemd[1]: Reached target cryptsetup.target - Local Encrypted Volumes. Sep 12 17:44:23.938324 systemd[1]: Reached target paths.target - Path Units. Sep 12 17:44:23.938336 systemd[1]: Reached target slices.target - Slice Units. Sep 12 17:44:23.938363 systemd[1]: Reached target swap.target - Swaps. Sep 12 17:44:23.938373 systemd[1]: Reached target timers.target - Timer Units. Sep 12 17:44:23.938384 systemd[1]: Listening on iscsid.socket - Open-iSCSI iscsid Socket. Sep 12 17:44:23.938394 systemd[1]: Listening on iscsiuio.socket - Open-iSCSI iscsiuio Socket. Sep 12 17:44:23.938405 systemd[1]: Listening on systemd-journald-dev-log.socket - Journal Socket (/dev/log). Sep 12 17:44:23.938416 systemd[1]: Listening on systemd-journald.socket - Journal Socket. Sep 12 17:44:23.938427 systemd[1]: Listening on systemd-networkd.socket - Network Service Netlink Socket. Sep 12 17:44:23.938437 systemd[1]: Listening on systemd-udevd-control.socket - udev Control Socket. Sep 12 17:44:23.938451 systemd[1]: Listening on systemd-udevd-kernel.socket - udev Kernel Socket. Sep 12 17:44:23.938461 systemd[1]: Reached target sockets.target - Socket Units. Sep 12 17:44:23.938472 systemd[1]: Starting ignition-setup-pre.service - Ignition env setup... Sep 12 17:44:23.938482 systemd[1]: Starting kmod-static-nodes.service - Create List of Static Device Nodes... Sep 12 17:44:23.938497 systemd[1]: Finished network-cleanup.service - Network Cleanup. Sep 12 17:44:23.938508 systemd[1]: Starting systemd-fsck-usr.service... Sep 12 17:44:23.938519 systemd[1]: Starting systemd-journald.service - Journal Service... Sep 12 17:44:23.938529 systemd[1]: Starting systemd-modules-load.service - Load Kernel Modules... Sep 12 17:44:23.938540 systemd[1]: Starting systemd-vconsole-setup.service - Virtual Console Setup... Sep 12 17:44:23.938554 systemd[1]: Finished ignition-setup-pre.service - Ignition env setup. Sep 12 17:44:23.938564 systemd[1]: Finished kmod-static-nodes.service - Create List of Static Device Nodes. Sep 12 17:44:23.938575 systemd[1]: Finished systemd-fsck-usr.service. Sep 12 17:44:23.938586 systemd[1]: Starting systemd-tmpfiles-setup-dev-early.service - Create Static Device Nodes in /dev gracefully... Sep 12 17:44:23.938622 systemd-journald[192]: Collecting audit messages is disabled. Sep 12 17:44:23.938646 systemd[1]: Finished systemd-vconsole-setup.service - Virtual Console Setup. Sep 12 17:44:23.938658 systemd[1]: Finished systemd-tmpfiles-setup-dev-early.service - Create Static Device Nodes in /dev gracefully. Sep 12 17:44:23.938668 systemd-journald[192]: Journal started Sep 12 17:44:23.938694 systemd-journald[192]: Runtime Journal (/run/log/journal/8932748ee4f24fd6a3d8f264c395d347) is 6.0M, max 48.3M, 42.2M free. Sep 12 17:44:23.929619 systemd-modules-load[193]: Inserted module 'overlay' Sep 12 17:44:23.949761 systemd[1]: Starting dracut-cmdline-ask.service - dracut ask for additional cmdline parameters... Sep 12 17:44:23.954111 systemd[1]: Starting systemd-tmpfiles-setup-dev.service - Create Static Device Nodes in /dev... Sep 12 17:44:23.956360 systemd[1]: Started systemd-journald.service - Journal Service. Sep 12 17:44:23.962850 kernel: bridge: filtering via arp/ip/ip6tables is no longer available by default. Update your scripts to load br_netfilter if you need this. Sep 12 17:44:23.962166 systemd[1]: Starting systemd-tmpfiles-setup.service - Create System Files and Directories... Sep 12 17:44:23.966485 kernel: Bridge firewalling registered Sep 12 17:44:23.965427 systemd-modules-load[193]: Inserted module 'br_netfilter' Sep 12 17:44:23.967154 systemd[1]: Finished systemd-modules-load.service - Load Kernel Modules. Sep 12 17:44:23.970589 systemd[1]: Starting systemd-sysctl.service - Apply Kernel Variables... Sep 12 17:44:23.971904 systemd[1]: Finished systemd-tmpfiles-setup-dev.service - Create Static Device Nodes in /dev. Sep 12 17:44:23.972882 systemd[1]: Finished dracut-cmdline-ask.service - dracut ask for additional cmdline parameters. Sep 12 17:44:23.979556 systemd[1]: Starting dracut-cmdline.service - dracut cmdline hook... Sep 12 17:44:23.985821 systemd[1]: Finished systemd-sysctl.service - Apply Kernel Variables. Sep 12 17:44:23.994638 systemd[1]: Finished systemd-tmpfiles-setup.service - Create System Files and Directories. Sep 12 17:44:23.997430 dracut-cmdline[223]: dracut-dracut-053 Sep 12 17:44:24.003476 dracut-cmdline[223]: Using kernel command line parameters: rd.driver.pre=btrfs rootflags=rw mount.usrflags=ro 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=ttyS0,115200 flatcar.first_boot=detected verity.usrhash=1ff9ec556ac80c67ae2340139aa421bf26af13357ec9e72632b4878e9945dc9a Sep 12 17:44:24.001543 systemd[1]: Starting systemd-resolved.service - Network Name Resolution... Sep 12 17:44:24.044660 systemd-resolved[238]: Positive Trust Anchors: Sep 12 17:44:24.044679 systemd-resolved[238]: . IN DS 20326 8 2 e06d44b80b8f1d39a95c0b0d7c65d08458e880409bbc683457104237c7f8ec8d Sep 12 17:44:24.044715 systemd-resolved[238]: Negative trust anchors: home.arpa 10.in-addr.arpa 16.172.in-addr.arpa 17.172.in-addr.arpa 18.172.in-addr.arpa 19.172.in-addr.arpa 20.172.in-addr.arpa 21.172.in-addr.arpa 22.172.in-addr.arpa 23.172.in-addr.arpa 24.172.in-addr.arpa 25.172.in-addr.arpa 26.172.in-addr.arpa 27.172.in-addr.arpa 28.172.in-addr.arpa 29.172.in-addr.arpa 30.172.in-addr.arpa 31.172.in-addr.arpa 170.0.0.192.in-addr.arpa 171.0.0.192.in-addr.arpa 168.192.in-addr.arpa d.f.ip6.arpa ipv4only.arpa resolver.arpa corp home internal intranet lan local private test Sep 12 17:44:24.047702 systemd-resolved[238]: Defaulting to hostname 'linux'. Sep 12 17:44:24.048895 systemd[1]: Started systemd-resolved.service - Network Name Resolution. Sep 12 17:44:24.055247 systemd[1]: Reached target nss-lookup.target - Host and Network Name Lookups. Sep 12 17:44:24.119374 kernel: SCSI subsystem initialized Sep 12 17:44:24.128366 kernel: Loading iSCSI transport class v2.0-870. Sep 12 17:44:24.139373 kernel: iscsi: registered transport (tcp) Sep 12 17:44:24.161404 kernel: iscsi: registered transport (qla4xxx) Sep 12 17:44:24.161498 kernel: QLogic iSCSI HBA Driver Sep 12 17:44:24.212409 systemd[1]: Finished dracut-cmdline.service - dracut cmdline hook. Sep 12 17:44:24.226494 systemd[1]: Starting dracut-pre-udev.service - dracut pre-udev hook... Sep 12 17:44:24.252778 kernel: device-mapper: core: CONFIG_IMA_DISABLE_HTABLE is disabled. Duplicate IMA measurements will not be recorded in the IMA log. Sep 12 17:44:24.252858 kernel: device-mapper: uevent: version 1.0.3 Sep 12 17:44:24.253781 kernel: device-mapper: ioctl: 4.48.0-ioctl (2023-03-01) initialised: dm-devel@redhat.com Sep 12 17:44:24.299378 kernel: raid6: avx2x4 gen() 23956 MB/s Sep 12 17:44:24.316368 kernel: raid6: avx2x2 gen() 30632 MB/s Sep 12 17:44:24.333405 kernel: raid6: avx2x1 gen() 25558 MB/s Sep 12 17:44:24.333429 kernel: raid6: using algorithm avx2x2 gen() 30632 MB/s Sep 12 17:44:24.351403 kernel: raid6: .... xor() 19620 MB/s, rmw enabled Sep 12 17:44:24.351419 kernel: raid6: using avx2x2 recovery algorithm Sep 12 17:44:24.375386 kernel: xor: automatically using best checksumming function avx Sep 12 17:44:24.531380 kernel: Btrfs loaded, zoned=no, fsverity=no Sep 12 17:44:24.545855 systemd[1]: Finished dracut-pre-udev.service - dracut pre-udev hook. Sep 12 17:44:24.561551 systemd[1]: Starting systemd-udevd.service - Rule-based Manager for Device Events and Files... Sep 12 17:44:24.574910 systemd-udevd[413]: Using default interface naming scheme 'v255'. Sep 12 17:44:24.580131 systemd[1]: Started systemd-udevd.service - Rule-based Manager for Device Events and Files. Sep 12 17:44:24.587492 systemd[1]: Starting dracut-pre-trigger.service - dracut pre-trigger hook... Sep 12 17:44:24.604139 dracut-pre-trigger[421]: rd.md=0: removing MD RAID activation Sep 12 17:44:24.640742 systemd[1]: Finished dracut-pre-trigger.service - dracut pre-trigger hook. Sep 12 17:44:24.664587 systemd[1]: Starting systemd-udev-trigger.service - Coldplug All udev Devices... Sep 12 17:44:24.731798 systemd[1]: Finished systemd-udev-trigger.service - Coldplug All udev Devices. Sep 12 17:44:24.743151 systemd[1]: Starting dracut-initqueue.service - dracut initqueue hook... Sep 12 17:44:24.759104 systemd[1]: Finished dracut-initqueue.service - dracut initqueue hook. Sep 12 17:44:24.763503 systemd[1]: Reached target remote-fs-pre.target - Preparation for Remote File Systems. Sep 12 17:44:24.766471 systemd[1]: Reached target remote-cryptsetup.target - Remote Encrypted Volumes. Sep 12 17:44:24.769246 systemd[1]: Reached target remote-fs.target - Remote File Systems. Sep 12 17:44:24.777625 kernel: virtio_blk virtio1: 4/0/0 default/read/poll queues Sep 12 17:44:24.777872 kernel: virtio_blk virtio1: [vda] 9289728 512-byte logical blocks (4.76 GB/4.43 GiB) Sep 12 17:44:24.781566 systemd[1]: Starting dracut-pre-mount.service - dracut pre-mount hook... Sep 12 17:44:24.782920 kernel: cryptd: max_cpu_qlen set to 1000 Sep 12 17:44:24.791717 systemd[1]: Finished dracut-pre-mount.service - dracut pre-mount hook. Sep 12 17:44:24.796355 kernel: vda: vda1 vda2 vda3 vda4 vda6 vda7 vda9 Sep 12 17:44:24.805142 systemd[1]: dracut-cmdline-ask.service: Deactivated successfully. Sep 12 17:44:24.805267 systemd[1]: Stopped dracut-cmdline-ask.service - dracut ask for additional cmdline parameters. Sep 12 17:44:24.812359 kernel: libata version 3.00 loaded. Sep 12 17:44:24.809301 systemd[1]: Stopping dracut-cmdline-ask.service - dracut ask for additional cmdline parameters... Sep 12 17:44:24.810603 systemd[1]: systemd-vconsole-setup.service: Deactivated successfully. Sep 12 17:44:24.810728 systemd[1]: Stopped systemd-vconsole-setup.service - Virtual Console Setup. Sep 12 17:44:24.811880 systemd[1]: Stopping systemd-vconsole-setup.service - Virtual Console Setup... Sep 12 17:44:24.821989 kernel: AVX2 version of gcm_enc/dec engaged. Sep 12 17:44:24.822011 kernel: AES CTR mode by8 optimization enabled Sep 12 17:44:24.822032 kernel: ahci 0000:00:1f.2: version 3.0 Sep 12 17:44:24.823361 kernel: ACPI: \_SB_.GSIA: Enabled at IRQ 16 Sep 12 17:44:24.825176 systemd[1]: Starting systemd-vconsole-setup.service - Virtual Console Setup... Sep 12 17:44:24.831308 kernel: ahci 0000:00:1f.2: AHCI 0001.0000 32 slots 6 ports 1.5 Gbps 0x3f impl SATA mode Sep 12 17:44:24.831638 kernel: ahci 0000:00:1f.2: flags: 64bit ncq only Sep 12 17:44:24.841425 kernel: BTRFS: device label OEM devid 1 transid 9 /dev/vda6 scanned by (udev-worker) (462) Sep 12 17:44:24.847399 kernel: BTRFS: device fsid 6dad227e-2c0d-42e6-b0d2-5c756384bc19 devid 1 transid 34 /dev/vda3 scanned by (udev-worker) (456) Sep 12 17:44:24.849374 kernel: scsi host0: ahci Sep 12 17:44:24.850965 systemd[1]: Found device dev-disk-by\x2dlabel-EFI\x2dSYSTEM.device - /dev/disk/by-label/EFI-SYSTEM. Sep 12 17:44:24.857446 kernel: scsi host1: ahci Sep 12 17:44:24.857693 kernel: scsi host2: ahci Sep 12 17:44:24.857873 kernel: scsi host3: ahci Sep 12 17:44:24.858063 kernel: scsi host4: ahci Sep 12 17:44:24.858210 kernel: scsi host5: ahci Sep 12 17:44:24.858383 kernel: ata1: SATA max UDMA/133 abar m4096@0xc1040000 port 0xc1040100 irq 34 Sep 12 17:44:24.858399 kernel: ata2: SATA max UDMA/133 abar m4096@0xc1040000 port 0xc1040180 irq 34 Sep 12 17:44:24.858410 kernel: ata3: SATA max UDMA/133 abar m4096@0xc1040000 port 0xc1040200 irq 34 Sep 12 17:44:24.858420 kernel: ata4: SATA max UDMA/133 abar m4096@0xc1040000 port 0xc1040280 irq 34 Sep 12 17:44:24.859923 systemd[1]: Finished systemd-vconsole-setup.service - Virtual Console Setup. Sep 12 17:44:24.864606 kernel: ata5: SATA max UDMA/133 abar m4096@0xc1040000 port 0xc1040300 irq 34 Sep 12 17:44:24.864627 kernel: ata6: SATA max UDMA/133 abar m4096@0xc1040000 port 0xc1040380 irq 34 Sep 12 17:44:24.881048 systemd[1]: Found device dev-disk-by\x2dlabel-ROOT.device - /dev/disk/by-label/ROOT. Sep 12 17:44:24.887920 systemd[1]: Found device dev-disk-by\x2dlabel-OEM.device - /dev/disk/by-label/OEM. Sep 12 17:44:24.894049 systemd[1]: Found device dev-disk-by\x2dpartuuid-7130c94a\x2d213a\x2d4e5a\x2d8e26\x2d6cce9662f132.device - /dev/disk/by-partuuid/7130c94a-213a-4e5a-8e26-6cce9662f132. Sep 12 17:44:24.895447 systemd[1]: Found device dev-disk-by\x2dpartlabel-USR\x2dA.device - /dev/disk/by-partlabel/USR-A. Sep 12 17:44:24.912479 systemd[1]: Starting disk-uuid.service - Generate new UUID for disk GPT if necessary... Sep 12 17:44:24.914756 systemd[1]: systemd-vconsole-setup.service: Deactivated successfully. Sep 12 17:44:24.914820 systemd[1]: Stopped systemd-vconsole-setup.service - Virtual Console Setup. Sep 12 17:44:24.918378 systemd[1]: Stopping systemd-vconsole-setup.service - Virtual Console Setup... Sep 12 17:44:24.921620 systemd[1]: Starting systemd-vconsole-setup.service - Virtual Console Setup... Sep 12 17:44:24.927745 kernel: vda: vda1 vda2 vda3 vda4 vda6 vda7 vda9 Sep 12 17:44:24.932428 kernel: vda: vda1 vda2 vda3 vda4 vda6 vda7 vda9 Sep 12 17:44:24.936999 systemd[1]: Finished systemd-vconsole-setup.service - Virtual Console Setup. Sep 12 17:44:24.949548 systemd[1]: Starting dracut-cmdline-ask.service - dracut ask for additional cmdline parameters... Sep 12 17:44:24.978634 systemd[1]: Finished dracut-cmdline-ask.service - dracut ask for additional cmdline parameters. Sep 12 17:44:25.172554 kernel: ata4: SATA link down (SStatus 0 SControl 300) Sep 12 17:44:25.172615 kernel: ata1: SATA link down (SStatus 0 SControl 300) Sep 12 17:44:25.172629 kernel: ata6: SATA link down (SStatus 0 SControl 300) Sep 12 17:44:25.174380 kernel: ata2: SATA link down (SStatus 0 SControl 300) Sep 12 17:44:25.174462 kernel: ata3: SATA link up 1.5 Gbps (SStatus 113 SControl 300) Sep 12 17:44:25.175839 kernel: ata3.00: ATAPI: QEMU DVD-ROM, 2.5+, max UDMA/100 Sep 12 17:44:25.175866 kernel: ata3.00: applying bridge limits Sep 12 17:44:25.177374 kernel: ata5: SATA link down (SStatus 0 SControl 300) Sep 12 17:44:25.177389 kernel: ata3.00: configured for UDMA/100 Sep 12 17:44:25.178369 kernel: scsi 2:0:0:0: CD-ROM QEMU QEMU DVD-ROM 2.5+ PQ: 0 ANSI: 5 Sep 12 17:44:25.250792 kernel: sr 2:0:0:0: [sr0] scsi3-mmc drive: 4x/4x cd/rw xa/form2 tray Sep 12 17:44:25.251080 kernel: cdrom: Uniform CD-ROM driver Revision: 3.20 Sep 12 17:44:25.263365 kernel: sr 2:0:0:0: Attached scsi CD-ROM sr0 Sep 12 17:44:25.936247 disk-uuid[553]: The operation has completed successfully. Sep 12 17:44:25.937793 kernel: vda: vda1 vda2 vda3 vda4 vda6 vda7 vda9 Sep 12 17:44:25.964677 systemd[1]: disk-uuid.service: Deactivated successfully. Sep 12 17:44:25.964804 systemd[1]: Finished disk-uuid.service - Generate new UUID for disk GPT if necessary. Sep 12 17:44:25.994570 systemd[1]: Starting verity-setup.service - Verity Setup for /dev/mapper/usr... Sep 12 17:44:25.998639 sh[595]: Success Sep 12 17:44:26.012368 kernel: device-mapper: verity: sha256 using implementation "sha256-ni" Sep 12 17:44:26.048012 systemd[1]: Found device dev-mapper-usr.device - /dev/mapper/usr. Sep 12 17:44:26.066470 systemd[1]: Mounting sysusr-usr.mount - /sysusr/usr... Sep 12 17:44:26.069563 systemd[1]: Finished verity-setup.service - Verity Setup for /dev/mapper/usr. Sep 12 17:44:26.084327 kernel: BTRFS info (device dm-0): first mount of filesystem 6dad227e-2c0d-42e6-b0d2-5c756384bc19 Sep 12 17:44:26.084381 kernel: BTRFS info (device dm-0): using crc32c (crc32c-intel) checksum algorithm Sep 12 17:44:26.084396 kernel: BTRFS warning (device dm-0): 'nologreplay' is deprecated, use 'rescue=nologreplay' instead Sep 12 17:44:26.086437 kernel: BTRFS info (device dm-0): disabling log replay at mount time Sep 12 17:44:26.086454 kernel: BTRFS info (device dm-0): using free space tree Sep 12 17:44:26.092388 systemd[1]: Mounted sysusr-usr.mount - /sysusr/usr. Sep 12 17:44:26.094890 systemd[1]: afterburn-network-kargs.service - Afterburn Initrd Setup Network Kernel Arguments was skipped because no trigger condition checks were met. Sep 12 17:44:26.107474 systemd[1]: Starting ignition-setup.service - Ignition (setup)... Sep 12 17:44:26.110150 systemd[1]: Starting parse-ip-for-networkd.service - Write systemd-networkd units from cmdline... Sep 12 17:44:26.120304 kernel: BTRFS info (device vda6): first mount of filesystem 4080f51d-d3f2-4545-8f59-3798077218dc Sep 12 17:44:26.120364 kernel: BTRFS info (device vda6): using crc32c (crc32c-intel) checksum algorithm Sep 12 17:44:26.120378 kernel: BTRFS info (device vda6): using free space tree Sep 12 17:44:26.123380 kernel: BTRFS info (device vda6): auto enabling async discard Sep 12 17:44:26.133793 systemd[1]: mnt-oem.mount: Deactivated successfully. Sep 12 17:44:26.135538 kernel: BTRFS info (device vda6): last unmount of filesystem 4080f51d-d3f2-4545-8f59-3798077218dc Sep 12 17:44:26.146466 systemd[1]: Finished ignition-setup.service - Ignition (setup). Sep 12 17:44:26.155523 systemd[1]: Starting ignition-fetch-offline.service - Ignition (fetch-offline)... Sep 12 17:44:26.215864 ignition[689]: Ignition 2.19.0 Sep 12 17:44:26.216629 ignition[689]: Stage: fetch-offline Sep 12 17:44:26.216674 ignition[689]: no configs at "/usr/lib/ignition/base.d" Sep 12 17:44:26.216685 ignition[689]: no config dir at "/usr/lib/ignition/base.platform.d/qemu" Sep 12 17:44:26.216787 ignition[689]: parsed url from cmdline: "" Sep 12 17:44:26.216792 ignition[689]: no config URL provided Sep 12 17:44:26.216797 ignition[689]: reading system config file "/usr/lib/ignition/user.ign" Sep 12 17:44:26.216806 ignition[689]: no config at "/usr/lib/ignition/user.ign" Sep 12 17:44:26.216833 ignition[689]: op(1): [started] loading QEMU firmware config module Sep 12 17:44:26.216838 ignition[689]: op(1): executing: "modprobe" "qemu_fw_cfg" Sep 12 17:44:26.225454 ignition[689]: op(1): [finished] loading QEMU firmware config module Sep 12 17:44:26.226916 ignition[689]: parsing config with SHA512: 9946c220b4bb8e6b63a70591fb6887aa6ae83ecb8fdce98d2c0798140520de665cb709f5687a08d31917f90e0a392279b01f0f18058f88eea7f2e6e694878308 Sep 12 17:44:26.233709 unknown[689]: fetched base config from "system" Sep 12 17:44:26.233973 ignition[689]: fetch-offline: fetch-offline passed Sep 12 17:44:26.233730 unknown[689]: fetched user config from "qemu" Sep 12 17:44:26.234081 ignition[689]: Ignition finished successfully Sep 12 17:44:26.237559 systemd[1]: Finished ignition-fetch-offline.service - Ignition (fetch-offline). Sep 12 17:44:26.246079 systemd[1]: Finished parse-ip-for-networkd.service - Write systemd-networkd units from cmdline. Sep 12 17:44:26.257599 systemd[1]: Starting systemd-networkd.service - Network Configuration... Sep 12 17:44:26.281324 systemd-networkd[786]: lo: Link UP Sep 12 17:44:26.281348 systemd-networkd[786]: lo: Gained carrier Sep 12 17:44:26.283283 systemd-networkd[786]: Enumeration completed Sep 12 17:44:26.283391 systemd[1]: Started systemd-networkd.service - Network Configuration. Sep 12 17:44:26.283770 systemd-networkd[786]: eth0: found matching network '/usr/lib/systemd/network/zz-default.network', based on potentially unpredictable interface name. Sep 12 17:44:26.283775 systemd-networkd[786]: eth0: Configuring with /usr/lib/systemd/network/zz-default.network. Sep 12 17:44:26.284151 systemd[1]: Reached target network.target - Network. Sep 12 17:44:26.284813 systemd-networkd[786]: eth0: Link UP Sep 12 17:44:26.284818 systemd-networkd[786]: eth0: Gained carrier Sep 12 17:44:26.284826 systemd-networkd[786]: eth0: found matching network '/usr/lib/systemd/network/zz-default.network', based on potentially unpredictable interface name. Sep 12 17:44:26.287610 systemd[1]: ignition-fetch.service - Ignition (fetch) was skipped because of an unmet condition check (ConditionPathExists=!/run/ignition.json). Sep 12 17:44:26.300504 systemd[1]: Starting ignition-kargs.service - Ignition (kargs)... Sep 12 17:44:26.313385 systemd-networkd[786]: eth0: DHCPv4 address 10.0.0.158/16, gateway 10.0.0.1 acquired from 10.0.0.1 Sep 12 17:44:26.314707 ignition[790]: Ignition 2.19.0 Sep 12 17:44:26.314715 ignition[790]: Stage: kargs Sep 12 17:44:26.314895 ignition[790]: no configs at "/usr/lib/ignition/base.d" Sep 12 17:44:26.314908 ignition[790]: no config dir at "/usr/lib/ignition/base.platform.d/qemu" Sep 12 17:44:26.315659 ignition[790]: kargs: kargs passed Sep 12 17:44:26.315704 ignition[790]: Ignition finished successfully Sep 12 17:44:26.319228 systemd[1]: Finished ignition-kargs.service - Ignition (kargs). Sep 12 17:44:26.334650 systemd[1]: Starting ignition-disks.service - Ignition (disks)... Sep 12 17:44:26.347018 ignition[799]: Ignition 2.19.0 Sep 12 17:44:26.347028 ignition[799]: Stage: disks Sep 12 17:44:26.347190 ignition[799]: no configs at "/usr/lib/ignition/base.d" Sep 12 17:44:26.347201 ignition[799]: no config dir at "/usr/lib/ignition/base.platform.d/qemu" Sep 12 17:44:26.350132 systemd[1]: Finished ignition-disks.service - Ignition (disks). Sep 12 17:44:26.347786 ignition[799]: disks: disks passed Sep 12 17:44:26.352017 systemd[1]: Reached target initrd-root-device.target - Initrd Root Device. Sep 12 17:44:26.347831 ignition[799]: Ignition finished successfully Sep 12 17:44:26.354026 systemd[1]: Reached target local-fs-pre.target - Preparation for Local File Systems. Sep 12 17:44:26.356010 systemd[1]: Reached target local-fs.target - Local File Systems. Sep 12 17:44:26.358198 systemd[1]: Reached target sysinit.target - System Initialization. Sep 12 17:44:26.359315 systemd[1]: Reached target basic.target - Basic System. Sep 12 17:44:26.371552 systemd[1]: Starting systemd-fsck-root.service - File System Check on /dev/disk/by-label/ROOT... Sep 12 17:44:26.383796 systemd-fsck[809]: ROOT: clean, 14/553520 files, 52654/553472 blocks Sep 12 17:44:26.390082 systemd[1]: Finished systemd-fsck-root.service - File System Check on /dev/disk/by-label/ROOT. Sep 12 17:44:26.391502 systemd[1]: Mounting sysroot.mount - /sysroot... Sep 12 17:44:26.482359 kernel: EXT4-fs (vda9): mounted filesystem 791ad691-63ae-4dbc-8ce3-6c8819e56736 r/w with ordered data mode. Quota mode: none. Sep 12 17:44:26.483297 systemd[1]: Mounted sysroot.mount - /sysroot. Sep 12 17:44:26.485699 systemd[1]: Reached target initrd-root-fs.target - Initrd Root File System. Sep 12 17:44:26.497432 systemd[1]: Mounting sysroot-oem.mount - /sysroot/oem... Sep 12 17:44:26.499318 systemd[1]: Mounting sysroot-usr.mount - /sysroot/usr... Sep 12 17:44:26.500736 systemd[1]: flatcar-metadata-hostname.service - Flatcar Metadata Hostname Agent was skipped because no trigger condition checks were met. Sep 12 17:44:26.500776 systemd[1]: ignition-remount-sysroot.service - Remount /sysroot read-write for Ignition was skipped because of an unmet condition check (ConditionPathIsReadWrite=!/sysroot). Sep 12 17:44:26.512937 kernel: BTRFS: device label OEM devid 1 transid 10 /dev/vda6 scanned by mount (817) Sep 12 17:44:26.512955 kernel: BTRFS info (device vda6): first mount of filesystem 4080f51d-d3f2-4545-8f59-3798077218dc Sep 12 17:44:26.512966 kernel: BTRFS info (device vda6): using crc32c (crc32c-intel) checksum algorithm Sep 12 17:44:26.512984 kernel: BTRFS info (device vda6): using free space tree Sep 12 17:44:26.500799 systemd[1]: Reached target ignition-diskful.target - Ignition Boot Disk Setup. Sep 12 17:44:26.507546 systemd[1]: Mounted sysroot-usr.mount - /sysroot/usr. Sep 12 17:44:26.510884 systemd[1]: Starting initrd-setup-root.service - Root filesystem setup... Sep 12 17:44:26.517076 kernel: BTRFS info (device vda6): auto enabling async discard Sep 12 17:44:26.517485 systemd[1]: Mounted sysroot-oem.mount - /sysroot/oem. Sep 12 17:44:26.550373 initrd-setup-root[841]: cut: /sysroot/etc/passwd: No such file or directory Sep 12 17:44:26.555329 initrd-setup-root[848]: cut: /sysroot/etc/group: No such file or directory Sep 12 17:44:26.560258 initrd-setup-root[855]: cut: /sysroot/etc/shadow: No such file or directory Sep 12 17:44:26.563813 initrd-setup-root[862]: cut: /sysroot/etc/gshadow: No such file or directory Sep 12 17:44:26.651988 systemd[1]: Finished initrd-setup-root.service - Root filesystem setup. Sep 12 17:44:26.663441 systemd[1]: Starting ignition-mount.service - Ignition (mount)... Sep 12 17:44:26.665272 systemd[1]: Starting sysroot-boot.service - /sysroot/boot... Sep 12 17:44:26.672358 kernel: BTRFS info (device vda6): last unmount of filesystem 4080f51d-d3f2-4545-8f59-3798077218dc Sep 12 17:44:26.690696 systemd[1]: Finished sysroot-boot.service - /sysroot/boot. Sep 12 17:44:26.694222 ignition[930]: INFO : Ignition 2.19.0 Sep 12 17:44:26.694222 ignition[930]: INFO : Stage: mount Sep 12 17:44:26.696003 ignition[930]: INFO : no configs at "/usr/lib/ignition/base.d" Sep 12 17:44:26.696003 ignition[930]: INFO : no config dir at "/usr/lib/ignition/base.platform.d/qemu" Sep 12 17:44:26.696003 ignition[930]: INFO : mount: mount passed Sep 12 17:44:26.696003 ignition[930]: INFO : Ignition finished successfully Sep 12 17:44:26.701538 systemd[1]: Finished ignition-mount.service - Ignition (mount). Sep 12 17:44:26.714441 systemd[1]: Starting ignition-files.service - Ignition (files)... Sep 12 17:44:27.083246 systemd[1]: sysroot-oem.mount: Deactivated successfully. Sep 12 17:44:27.095523 systemd[1]: Mounting sysroot-oem.mount - /sysroot/oem... Sep 12 17:44:27.105068 kernel: BTRFS: device label OEM devid 1 transid 11 /dev/vda6 scanned by mount (943) Sep 12 17:44:27.105097 kernel: BTRFS info (device vda6): first mount of filesystem 4080f51d-d3f2-4545-8f59-3798077218dc Sep 12 17:44:27.105110 kernel: BTRFS info (device vda6): using crc32c (crc32c-intel) checksum algorithm Sep 12 17:44:27.106035 kernel: BTRFS info (device vda6): using free space tree Sep 12 17:44:27.109369 kernel: BTRFS info (device vda6): auto enabling async discard Sep 12 17:44:27.111332 systemd[1]: Mounted sysroot-oem.mount - /sysroot/oem. Sep 12 17:44:27.148302 ignition[960]: INFO : Ignition 2.19.0 Sep 12 17:44:27.148302 ignition[960]: INFO : Stage: files Sep 12 17:44:27.150103 ignition[960]: INFO : no configs at "/usr/lib/ignition/base.d" Sep 12 17:44:27.150103 ignition[960]: INFO : no config dir at "/usr/lib/ignition/base.platform.d/qemu" Sep 12 17:44:27.152968 ignition[960]: DEBUG : files: compiled without relabeling support, skipping Sep 12 17:44:27.154770 ignition[960]: INFO : files: ensureUsers: op(1): [started] creating or modifying user "core" Sep 12 17:44:27.154770 ignition[960]: DEBUG : files: ensureUsers: op(1): executing: "usermod" "--root" "/sysroot" "core" Sep 12 17:44:27.158239 ignition[960]: INFO : files: ensureUsers: op(1): [finished] creating or modifying user "core" Sep 12 17:44:27.159929 ignition[960]: INFO : files: ensureUsers: op(2): [started] adding ssh keys to user "core" Sep 12 17:44:27.161806 unknown[960]: wrote ssh authorized keys file for user: core Sep 12 17:44:27.163205 ignition[960]: INFO : files: ensureUsers: op(2): [finished] adding ssh keys to user "core" Sep 12 17:44:27.164725 ignition[960]: INFO : files: createFilesystemsFiles: createFiles: op(3): [started] writing file "/sysroot/etc/flatcar/update.conf" Sep 12 17:44:27.164725 ignition[960]: INFO : files: createFilesystemsFiles: createFiles: op(3): [finished] writing file "/sysroot/etc/flatcar/update.conf" Sep 12 17:44:27.164725 ignition[960]: INFO : files: op(4): [started] processing unit "docker.service" Sep 12 17:44:27.164725 ignition[960]: INFO : files: op(4): [finished] processing unit "docker.service" Sep 12 17:44:27.164725 ignition[960]: INFO : files: op(5): [started] processing unit "coreos-metadata.service" Sep 12 17:44:27.164725 ignition[960]: INFO : files: op(5): op(6): [started] writing unit "coreos-metadata.service" at "/sysroot/etc/systemd/system/coreos-metadata.service" Sep 12 17:44:27.164725 ignition[960]: INFO : files: op(5): op(6): [finished] writing unit "coreos-metadata.service" at "/sysroot/etc/systemd/system/coreos-metadata.service" Sep 12 17:44:27.164725 ignition[960]: INFO : files: op(5): [finished] processing unit "coreos-metadata.service" Sep 12 17:44:27.164725 ignition[960]: INFO : files: op(7): [started] setting preset to disabled for "coreos-metadata.service" Sep 12 17:44:27.188970 ignition[960]: INFO : files: op(7): op(8): [started] removing enablement symlink(s) for "coreos-metadata.service" Sep 12 17:44:27.194358 ignition[960]: INFO : files: op(7): op(8): [finished] removing enablement symlink(s) for "coreos-metadata.service" Sep 12 17:44:27.196084 ignition[960]: INFO : files: op(7): [finished] setting preset to disabled for "coreos-metadata.service" Sep 12 17:44:27.196084 ignition[960]: INFO : files: op(9): [started] setting preset to enabled for "docker.service" Sep 12 17:44:27.196084 ignition[960]: INFO : files: op(9): [finished] setting preset to enabled for "docker.service" Sep 12 17:44:27.196084 ignition[960]: INFO : files: createResultFile: createFiles: op(a): [started] writing file "/sysroot/etc/.ignition-result.json" Sep 12 17:44:27.196084 ignition[960]: INFO : files: createResultFile: createFiles: op(a): [finished] writing file "/sysroot/etc/.ignition-result.json" Sep 12 17:44:27.196084 ignition[960]: INFO : files: files passed Sep 12 17:44:27.196084 ignition[960]: INFO : Ignition finished successfully Sep 12 17:44:27.207987 systemd[1]: Finished ignition-files.service - Ignition (files). Sep 12 17:44:27.214667 systemd[1]: Starting ignition-quench.service - Ignition (record completion)... Sep 12 17:44:27.217996 systemd[1]: Starting initrd-setup-root-after-ignition.service - Root filesystem completion... Sep 12 17:44:27.220932 systemd[1]: ignition-quench.service: Deactivated successfully. Sep 12 17:44:27.222057 systemd[1]: Finished ignition-quench.service - Ignition (record completion). Sep 12 17:44:27.227822 initrd-setup-root-after-ignition[988]: grep: /sysroot/oem/oem-release: No such file or directory Sep 12 17:44:27.232707 initrd-setup-root-after-ignition[990]: grep: /sysroot/etc/flatcar/enabled-sysext.conf: No such file or directory Sep 12 17:44:27.232707 initrd-setup-root-after-ignition[990]: grep: /sysroot/usr/share/flatcar/enabled-sysext.conf: No such file or directory Sep 12 17:44:27.237468 initrd-setup-root-after-ignition[994]: grep: /sysroot/etc/flatcar/enabled-sysext.conf: No such file or directory Sep 12 17:44:27.234471 systemd[1]: Finished initrd-setup-root-after-ignition.service - Root filesystem completion. Sep 12 17:44:27.238003 systemd[1]: Reached target ignition-complete.target - Ignition Complete. Sep 12 17:44:27.245514 systemd[1]: Starting initrd-parse-etc.service - Mountpoints Configured in the Real Root... Sep 12 17:44:27.274975 systemd[1]: initrd-parse-etc.service: Deactivated successfully. Sep 12 17:44:27.275125 systemd[1]: Finished initrd-parse-etc.service - Mountpoints Configured in the Real Root. Sep 12 17:44:27.277442 systemd[1]: Reached target initrd-fs.target - Initrd File Systems. Sep 12 17:44:27.279482 systemd[1]: Reached target initrd.target - Initrd Default Target. Sep 12 17:44:27.281518 systemd[1]: dracut-mount.service - dracut mount hook was skipped because no trigger condition checks were met. Sep 12 17:44:27.282375 systemd[1]: Starting dracut-pre-pivot.service - dracut pre-pivot and cleanup hook... Sep 12 17:44:27.303323 systemd[1]: Finished dracut-pre-pivot.service - dracut pre-pivot and cleanup hook. Sep 12 17:44:27.310591 systemd[1]: Starting initrd-cleanup.service - Cleaning Up and Shutting Down Daemons... Sep 12 17:44:27.319542 systemd[1]: Stopped target nss-lookup.target - Host and Network Name Lookups. Sep 12 17:44:27.321851 systemd[1]: Stopped target remote-cryptsetup.target - Remote Encrypted Volumes. Sep 12 17:44:27.324162 systemd[1]: Stopped target timers.target - Timer Units. Sep 12 17:44:27.325988 systemd[1]: dracut-pre-pivot.service: Deactivated successfully. Sep 12 17:44:27.327045 systemd[1]: Stopped dracut-pre-pivot.service - dracut pre-pivot and cleanup hook. Sep 12 17:44:27.329527 systemd[1]: Stopped target initrd.target - Initrd Default Target. Sep 12 17:44:27.331623 systemd[1]: Stopped target basic.target - Basic System. Sep 12 17:44:27.333431 systemd[1]: Stopped target ignition-complete.target - Ignition Complete. Sep 12 17:44:27.335594 systemd[1]: Stopped target ignition-diskful.target - Ignition Boot Disk Setup. Sep 12 17:44:27.337963 systemd[1]: Stopped target initrd-root-device.target - Initrd Root Device. Sep 12 17:44:27.340135 systemd[1]: Stopped target remote-fs.target - Remote File Systems. Sep 12 17:44:27.342187 systemd[1]: Stopped target remote-fs-pre.target - Preparation for Remote File Systems. Sep 12 17:44:27.344630 systemd[1]: Stopped target sysinit.target - System Initialization. Sep 12 17:44:27.346682 systemd[1]: Stopped target local-fs.target - Local File Systems. Sep 12 17:44:27.348658 systemd[1]: Stopped target swap.target - Swaps. Sep 12 17:44:27.350219 systemd[1]: dracut-pre-mount.service: Deactivated successfully. Sep 12 17:44:27.351189 systemd[1]: Stopped dracut-pre-mount.service - dracut pre-mount hook. Sep 12 17:44:27.353362 systemd[1]: Stopped target cryptsetup.target - Local Encrypted Volumes. Sep 12 17:44:27.355454 systemd[1]: Stopped target cryptsetup-pre.target - Local Encrypted Volumes (Pre). Sep 12 17:44:27.357767 systemd[1]: clevis-luks-askpass.path: Deactivated successfully. Sep 12 17:44:27.358722 systemd[1]: Stopped clevis-luks-askpass.path - Forward Password Requests to Clevis Directory Watch. Sep 12 17:44:27.361251 systemd[1]: dracut-initqueue.service: Deactivated successfully. Sep 12 17:44:27.362299 systemd[1]: Stopped dracut-initqueue.service - dracut initqueue hook. Sep 12 17:44:27.364505 systemd[1]: ignition-fetch-offline.service: Deactivated successfully. Sep 12 17:44:27.365586 systemd[1]: Stopped ignition-fetch-offline.service - Ignition (fetch-offline). Sep 12 17:44:27.367988 systemd[1]: Stopped target paths.target - Path Units. Sep 12 17:44:27.369718 systemd[1]: systemd-ask-password-console.path: Deactivated successfully. Sep 12 17:44:27.373390 systemd[1]: Stopped systemd-ask-password-console.path - Dispatch Password Requests to Console Directory Watch. Sep 12 17:44:27.376142 systemd[1]: Stopped target slices.target - Slice Units. Sep 12 17:44:27.377971 systemd[1]: Stopped target sockets.target - Socket Units. Sep 12 17:44:27.379834 systemd[1]: iscsid.socket: Deactivated successfully. Sep 12 17:44:27.380711 systemd[1]: Closed iscsid.socket - Open-iSCSI iscsid Socket. Sep 12 17:44:27.382640 systemd[1]: iscsiuio.socket: Deactivated successfully. Sep 12 17:44:27.383587 systemd[1]: Closed iscsiuio.socket - Open-iSCSI iscsiuio Socket. Sep 12 17:44:27.385624 systemd[1]: initrd-setup-root-after-ignition.service: Deactivated successfully. Sep 12 17:44:27.386792 systemd[1]: Stopped initrd-setup-root-after-ignition.service - Root filesystem completion. Sep 12 17:44:27.389352 systemd[1]: ignition-files.service: Deactivated successfully. Sep 12 17:44:27.390318 systemd[1]: Stopped ignition-files.service - Ignition (files). Sep 12 17:44:27.405479 systemd[1]: Stopping ignition-mount.service - Ignition (mount)... Sep 12 17:44:27.407375 systemd[1]: kmod-static-nodes.service: Deactivated successfully. Sep 12 17:44:27.408436 systemd[1]: Stopped kmod-static-nodes.service - Create List of Static Device Nodes. Sep 12 17:44:27.411688 systemd[1]: Stopping sysroot-boot.service - /sysroot/boot... Sep 12 17:44:27.412621 systemd[1]: systemd-udev-trigger.service: Deactivated successfully. Sep 12 17:44:27.412770 systemd[1]: Stopped systemd-udev-trigger.service - Coldplug All udev Devices. Sep 12 17:44:27.423218 ignition[1014]: INFO : Ignition 2.19.0 Sep 12 17:44:27.423218 ignition[1014]: INFO : Stage: umount Sep 12 17:44:27.423218 ignition[1014]: INFO : no configs at "/usr/lib/ignition/base.d" Sep 12 17:44:27.423218 ignition[1014]: INFO : no config dir at "/usr/lib/ignition/base.platform.d/qemu" Sep 12 17:44:27.423218 ignition[1014]: INFO : umount: umount passed Sep 12 17:44:27.423218 ignition[1014]: INFO : Ignition finished successfully Sep 12 17:44:27.414103 systemd[1]: dracut-pre-trigger.service: Deactivated successfully. Sep 12 17:44:27.414232 systemd[1]: Stopped dracut-pre-trigger.service - dracut pre-trigger hook. Sep 12 17:44:27.419305 systemd[1]: initrd-cleanup.service: Deactivated successfully. Sep 12 17:44:27.419446 systemd[1]: Finished initrd-cleanup.service - Cleaning Up and Shutting Down Daemons. Sep 12 17:44:27.432603 systemd[1]: ignition-mount.service: Deactivated successfully. Sep 12 17:44:27.432753 systemd[1]: Stopped ignition-mount.service - Ignition (mount). Sep 12 17:44:27.434087 systemd[1]: Stopped target network.target - Network. Sep 12 17:44:27.435575 systemd[1]: ignition-disks.service: Deactivated successfully. Sep 12 17:44:27.435633 systemd[1]: Stopped ignition-disks.service - Ignition (disks). Sep 12 17:44:27.437603 systemd[1]: ignition-kargs.service: Deactivated successfully. Sep 12 17:44:27.437655 systemd[1]: Stopped ignition-kargs.service - Ignition (kargs). Sep 12 17:44:27.439456 systemd[1]: ignition-setup.service: Deactivated successfully. Sep 12 17:44:27.439506 systemd[1]: Stopped ignition-setup.service - Ignition (setup). Sep 12 17:44:27.441493 systemd[1]: ignition-setup-pre.service: Deactivated successfully. Sep 12 17:44:27.441543 systemd[1]: Stopped ignition-setup-pre.service - Ignition env setup. Sep 12 17:44:27.443586 systemd[1]: Stopping systemd-networkd.service - Network Configuration... Sep 12 17:44:27.445593 systemd[1]: Stopping systemd-resolved.service - Network Name Resolution... Sep 12 17:44:27.447382 systemd-networkd[786]: eth0: DHCPv6 lease lost Sep 12 17:44:27.450211 systemd[1]: systemd-networkd.service: Deactivated successfully. Sep 12 17:44:27.450392 systemd[1]: Stopped systemd-networkd.service - Network Configuration. Sep 12 17:44:27.452904 systemd[1]: systemd-resolved.service: Deactivated successfully. Sep 12 17:44:27.453060 systemd[1]: Stopped systemd-resolved.service - Network Name Resolution. Sep 12 17:44:27.457629 systemd[1]: sysroot-boot.mount: Deactivated successfully. Sep 12 17:44:27.458698 systemd[1]: systemd-networkd.socket: Deactivated successfully. Sep 12 17:44:27.458769 systemd[1]: Closed systemd-networkd.socket - Network Service Netlink Socket. Sep 12 17:44:27.465462 systemd[1]: Stopping network-cleanup.service - Network Cleanup... Sep 12 17:44:27.467442 systemd[1]: parse-ip-for-networkd.service: Deactivated successfully. Sep 12 17:44:27.467509 systemd[1]: Stopped parse-ip-for-networkd.service - Write systemd-networkd units from cmdline. Sep 12 17:44:27.471007 systemd[1]: systemd-sysctl.service: Deactivated successfully. Sep 12 17:44:27.471062 systemd[1]: Stopped systemd-sysctl.service - Apply Kernel Variables. Sep 12 17:44:27.473889 systemd[1]: systemd-modules-load.service: Deactivated successfully. Sep 12 17:44:27.474881 systemd[1]: Stopped systemd-modules-load.service - Load Kernel Modules. Sep 12 17:44:27.476933 systemd[1]: systemd-tmpfiles-setup.service: Deactivated successfully. Sep 12 17:44:27.478088 systemd[1]: Stopped systemd-tmpfiles-setup.service - Create System Files and Directories. Sep 12 17:44:27.480624 systemd[1]: Stopping systemd-udevd.service - Rule-based Manager for Device Events and Files... Sep 12 17:44:27.482124 systemd[1]: sysroot-boot.service: Deactivated successfully. Sep 12 17:44:27.484883 systemd[1]: Stopped sysroot-boot.service - /sysroot/boot. Sep 12 17:44:27.491470 systemd[1]: initrd-setup-root.service: Deactivated successfully. Sep 12 17:44:27.491550 systemd[1]: Stopped initrd-setup-root.service - Root filesystem setup. Sep 12 17:44:27.494906 systemd[1]: systemd-udevd.service: Deactivated successfully. Sep 12 17:44:27.496042 systemd[1]: Stopped systemd-udevd.service - Rule-based Manager for Device Events and Files. Sep 12 17:44:27.498830 systemd[1]: network-cleanup.service: Deactivated successfully. Sep 12 17:44:27.499876 systemd[1]: Stopped network-cleanup.service - Network Cleanup. Sep 12 17:44:27.502930 systemd[1]: systemd-udevd-control.socket: Deactivated successfully. Sep 12 17:44:27.504021 systemd[1]: Closed systemd-udevd-control.socket - udev Control Socket. Sep 12 17:44:27.506066 systemd[1]: systemd-udevd-kernel.socket: Deactivated successfully. Sep 12 17:44:27.506120 systemd[1]: Closed systemd-udevd-kernel.socket - udev Kernel Socket. Sep 12 17:44:27.509074 systemd[1]: dracut-pre-udev.service: Deactivated successfully. Sep 12 17:44:27.509970 systemd[1]: Stopped dracut-pre-udev.service - dracut pre-udev hook. Sep 12 17:44:27.512127 systemd[1]: dracut-cmdline.service: Deactivated successfully. Sep 12 17:44:27.512179 systemd[1]: Stopped dracut-cmdline.service - dracut cmdline hook. Sep 12 17:44:27.515045 systemd[1]: dracut-cmdline-ask.service: Deactivated successfully. Sep 12 17:44:27.515101 systemd[1]: Stopped dracut-cmdline-ask.service - dracut ask for additional cmdline parameters. Sep 12 17:44:27.527464 systemd[1]: Starting initrd-udevadm-cleanup-db.service - Cleanup udev Database... Sep 12 17:44:27.529666 systemd[1]: systemd-tmpfiles-setup-dev.service: Deactivated successfully. Sep 12 17:44:27.529723 systemd[1]: Stopped systemd-tmpfiles-setup-dev.service - Create Static Device Nodes in /dev. Sep 12 17:44:27.533162 systemd[1]: systemd-vconsole-setup.service: Deactivated successfully. Sep 12 17:44:27.533211 systemd[1]: Stopped systemd-vconsole-setup.service - Virtual Console Setup. Sep 12 17:44:27.536665 systemd[1]: initrd-udevadm-cleanup-db.service: Deactivated successfully. Sep 12 17:44:27.537800 systemd[1]: Finished initrd-udevadm-cleanup-db.service - Cleanup udev Database. Sep 12 17:44:27.540526 systemd[1]: Reached target initrd-switch-root.target - Switch Root. Sep 12 17:44:27.563491 systemd[1]: Starting initrd-switch-root.service - Switch Root... Sep 12 17:44:27.571414 systemd[1]: Switching root. Sep 12 17:44:27.601684 systemd-journald[192]: Journal stopped Sep 12 17:44:28.438943 systemd-journald[192]: Received SIGTERM from PID 1 (systemd). Sep 12 17:44:28.439008 kernel: SELinux: policy capability network_peer_controls=1 Sep 12 17:44:28.439028 kernel: SELinux: policy capability open_perms=1 Sep 12 17:44:28.439040 kernel: SELinux: policy capability extended_socket_class=1 Sep 12 17:44:28.439056 kernel: SELinux: policy capability always_check_network=0 Sep 12 17:44:28.439067 kernel: SELinux: policy capability cgroup_seclabel=1 Sep 12 17:44:28.439079 kernel: SELinux: policy capability nnp_nosuid_transition=1 Sep 12 17:44:28.439090 kernel: SELinux: policy capability genfs_seclabel_symlinks=0 Sep 12 17:44:28.439101 kernel: SELinux: policy capability ioctl_skip_cloexec=0 Sep 12 17:44:28.439118 kernel: audit: type=1403 audit(1757699067.693:2): auid=4294967295 ses=4294967295 lsm=selinux res=1 Sep 12 17:44:28.439131 systemd[1]: Successfully loaded SELinux policy in 43.836ms. Sep 12 17:44:28.439149 systemd[1]: Relabeled /dev, /dev/shm, /run, /sys/fs/cgroup in 12.812ms. Sep 12 17:44:28.439165 systemd[1]: systemd 255 running in system mode (+PAM +AUDIT +SELINUX -APPARMOR +IMA +SMACK +SECCOMP +GCRYPT -GNUTLS +OPENSSL -ACL +BLKID +CURL +ELFUTILS -FIDO2 +IDN2 -IDN +IPTC +KMOD +LIBCRYPTSETUP +LIBFDISK +PCRE2 -PWQUALITY -P11KIT -QRENCODE +TPM2 +BZIP2 +LZ4 +XZ +ZLIB +ZSTD -BPF_FRAMEWORK -XKBCOMMON +UTMP -SYSVINIT default-hierarchy=unified) Sep 12 17:44:28.439181 systemd[1]: Detected virtualization kvm. Sep 12 17:44:28.439193 systemd[1]: Detected architecture x86-64. Sep 12 17:44:28.439205 systemd[1]: Detected first boot. Sep 12 17:44:28.439216 systemd[1]: Initializing machine ID from VM UUID. Sep 12 17:44:28.439228 zram_generator::config[1059]: No configuration found. Sep 12 17:44:28.439241 systemd[1]: Populated /etc with preset unit settings. Sep 12 17:44:28.439253 systemd[1]: initrd-switch-root.service: Deactivated successfully. Sep 12 17:44:28.439265 systemd[1]: Stopped initrd-switch-root.service - Switch Root. Sep 12 17:44:28.439279 systemd[1]: systemd-journald.service: Scheduled restart job, restart counter is at 1. Sep 12 17:44:28.439292 systemd[1]: Created slice system-addon\x2dconfig.slice - Slice /system/addon-config. Sep 12 17:44:28.439304 systemd[1]: Created slice system-addon\x2drun.slice - Slice /system/addon-run. Sep 12 17:44:28.439318 systemd[1]: Created slice system-getty.slice - Slice /system/getty. Sep 12 17:44:28.439332 systemd[1]: Created slice system-modprobe.slice - Slice /system/modprobe. Sep 12 17:44:28.439359 systemd[1]: Created slice system-serial\x2dgetty.slice - Slice /system/serial-getty. Sep 12 17:44:28.439371 systemd[1]: Created slice system-system\x2dcloudinit.slice - Slice /system/system-cloudinit. Sep 12 17:44:28.439384 systemd[1]: Created slice system-systemd\x2dfsck.slice - Slice /system/systemd-fsck. Sep 12 17:44:28.439396 systemd[1]: Created slice user.slice - User and Session Slice. Sep 12 17:44:28.439408 systemd[1]: Started clevis-luks-askpass.path - Forward Password Requests to Clevis Directory Watch. Sep 12 17:44:28.439420 systemd[1]: Started systemd-ask-password-console.path - Dispatch Password Requests to Console Directory Watch. Sep 12 17:44:28.439432 systemd[1]: Started systemd-ask-password-wall.path - Forward Password Requests to Wall Directory Watch. Sep 12 17:44:28.439444 systemd[1]: Set up automount boot.automount - Boot partition Automount Point. Sep 12 17:44:28.439461 systemd[1]: Set up automount proc-sys-fs-binfmt_misc.automount - Arbitrary Executable File Formats File System Automount Point. Sep 12 17:44:28.439475 systemd[1]: Expecting device dev-disk-by\x2dlabel-OEM.device - /dev/disk/by-label/OEM... Sep 12 17:44:28.439487 systemd[1]: Expecting device dev-ttyS0.device - /dev/ttyS0... Sep 12 17:44:28.439499 systemd[1]: Reached target cryptsetup-pre.target - Local Encrypted Volumes (Pre). Sep 12 17:44:28.439511 systemd[1]: Stopped target initrd-switch-root.target - Switch Root. Sep 12 17:44:28.439523 systemd[1]: Stopped target initrd-fs.target - Initrd File Systems. Sep 12 17:44:28.439534 systemd[1]: Stopped target initrd-root-fs.target - Initrd Root File System. Sep 12 17:44:28.439546 systemd[1]: Reached target integritysetup.target - Local Integrity Protected Volumes. Sep 12 17:44:28.439558 systemd[1]: Reached target remote-cryptsetup.target - Remote Encrypted Volumes. Sep 12 17:44:28.439576 systemd[1]: Reached target remote-fs.target - Remote File Systems. Sep 12 17:44:28.439589 systemd[1]: Reached target slices.target - Slice Units. Sep 12 17:44:28.439601 systemd[1]: Reached target swap.target - Swaps. Sep 12 17:44:28.439615 systemd[1]: Reached target veritysetup.target - Local Verity Protected Volumes. Sep 12 17:44:28.439627 systemd[1]: Listening on systemd-coredump.socket - Process Core Dump Socket. Sep 12 17:44:28.439638 systemd[1]: Listening on systemd-networkd.socket - Network Service Netlink Socket. Sep 12 17:44:28.439650 systemd[1]: Listening on systemd-udevd-control.socket - udev Control Socket. Sep 12 17:44:28.439662 systemd[1]: Listening on systemd-udevd-kernel.socket - udev Kernel Socket. Sep 12 17:44:28.439674 systemd[1]: Listening on systemd-userdbd.socket - User Database Manager Socket. Sep 12 17:44:28.439689 systemd[1]: Mounting dev-hugepages.mount - Huge Pages File System... Sep 12 17:44:28.439701 systemd[1]: Mounting dev-mqueue.mount - POSIX Message Queue File System... Sep 12 17:44:28.439713 systemd[1]: Mounting media.mount - External Media Directory... Sep 12 17:44:28.439725 systemd[1]: proc-xen.mount - /proc/xen was skipped because of an unmet condition check (ConditionVirtualization=xen). Sep 12 17:44:28.439737 systemd[1]: Mounting sys-kernel-debug.mount - Kernel Debug File System... Sep 12 17:44:28.439749 systemd[1]: Mounting sys-kernel-tracing.mount - Kernel Trace File System... Sep 12 17:44:28.439761 systemd[1]: Mounting tmp.mount - Temporary Directory /tmp... Sep 12 17:44:28.439773 systemd[1]: var-lib-machines.mount - Virtual Machine and Container Storage (Compatibility) was skipped because of an unmet condition check (ConditionPathExists=/var/lib/machines.raw). Sep 12 17:44:28.439789 systemd[1]: Reached target machines.target - Containers. Sep 12 17:44:28.439803 systemd[1]: Starting flatcar-tmpfiles.service - Create missing system files... Sep 12 17:44:28.439815 systemd[1]: ignition-delete-config.service - Ignition (delete config) was skipped because no trigger condition checks were met. Sep 12 17:44:28.439827 systemd[1]: Starting kmod-static-nodes.service - Create List of Static Device Nodes... Sep 12 17:44:28.439839 systemd[1]: Starting modprobe@configfs.service - Load Kernel Module configfs... Sep 12 17:44:28.439850 systemd[1]: Starting modprobe@dm_mod.service - Load Kernel Module dm_mod... Sep 12 17:44:28.439862 systemd[1]: Starting modprobe@drm.service - Load Kernel Module drm... Sep 12 17:44:28.439876 systemd[1]: Starting modprobe@efi_pstore.service - Load Kernel Module efi_pstore... Sep 12 17:44:28.439887 systemd[1]: Starting modprobe@fuse.service - Load Kernel Module fuse... Sep 12 17:44:28.439901 systemd[1]: Starting modprobe@loop.service - Load Kernel Module loop... Sep 12 17:44:28.439913 systemd[1]: setup-nsswitch.service - Create /etc/nsswitch.conf was skipped because of an unmet condition check (ConditionPathExists=!/etc/nsswitch.conf). Sep 12 17:44:28.439937 systemd[1]: systemd-fsck-root.service: Deactivated successfully. Sep 12 17:44:28.439949 systemd[1]: Stopped systemd-fsck-root.service - File System Check on Root Device. Sep 12 17:44:28.439961 systemd[1]: systemd-fsck-usr.service: Deactivated successfully. Sep 12 17:44:28.439973 systemd[1]: Stopped systemd-fsck-usr.service. Sep 12 17:44:28.439985 systemd[1]: Starting systemd-journald.service - Journal Service... Sep 12 17:44:28.439997 systemd[1]: Starting systemd-modules-load.service - Load Kernel Modules... Sep 12 17:44:28.440009 systemd[1]: Starting systemd-network-generator.service - Generate network units from Kernel command line... Sep 12 17:44:28.440024 kernel: fuse: init (API version 7.39) Sep 12 17:44:28.440035 systemd[1]: Starting systemd-remount-fs.service - Remount Root and Kernel File Systems... Sep 12 17:44:28.440047 kernel: loop: module loaded Sep 12 17:44:28.440058 systemd[1]: Starting systemd-udev-trigger.service - Coldplug All udev Devices... Sep 12 17:44:28.440070 systemd[1]: verity-setup.service: Deactivated successfully. Sep 12 17:44:28.440081 systemd[1]: Stopped verity-setup.service. Sep 12 17:44:28.440093 systemd[1]: xenserver-pv-version.service - Set fake PV driver version for XenServer was skipped because of an unmet condition check (ConditionVirtualization=xen). Sep 12 17:44:28.440105 systemd[1]: Mounted dev-hugepages.mount - Huge Pages File System. Sep 12 17:44:28.440137 systemd-journald[1129]: Collecting audit messages is disabled. Sep 12 17:44:28.440158 kernel: ACPI: bus type drm_connector registered Sep 12 17:44:28.440171 systemd[1]: Mounted dev-mqueue.mount - POSIX Message Queue File System. Sep 12 17:44:28.440183 systemd[1]: Mounted media.mount - External Media Directory. Sep 12 17:44:28.440198 systemd-journald[1129]: Journal started Sep 12 17:44:28.440220 systemd-journald[1129]: Runtime Journal (/run/log/journal/8932748ee4f24fd6a3d8f264c395d347) is 6.0M, max 48.3M, 42.2M free. Sep 12 17:44:28.201831 systemd[1]: Queued start job for default target multi-user.target. Sep 12 17:44:28.220864 systemd[1]: Unnecessary job was removed for dev-vda6.device - /dev/vda6. Sep 12 17:44:28.221359 systemd[1]: systemd-journald.service: Deactivated successfully. Sep 12 17:44:28.443366 systemd[1]: Started systemd-journald.service - Journal Service. Sep 12 17:44:28.444160 systemd[1]: Mounted sys-kernel-debug.mount - Kernel Debug File System. Sep 12 17:44:28.445360 systemd[1]: Mounted sys-kernel-tracing.mount - Kernel Trace File System. Sep 12 17:44:28.446603 systemd[1]: Mounted tmp.mount - Temporary Directory /tmp. Sep 12 17:44:28.447841 systemd[1]: Finished flatcar-tmpfiles.service - Create missing system files. Sep 12 17:44:28.449285 systemd[1]: Finished kmod-static-nodes.service - Create List of Static Device Nodes. Sep 12 17:44:28.450821 systemd[1]: modprobe@configfs.service: Deactivated successfully. Sep 12 17:44:28.451008 systemd[1]: Finished modprobe@configfs.service - Load Kernel Module configfs. Sep 12 17:44:28.452498 systemd[1]: modprobe@dm_mod.service: Deactivated successfully. Sep 12 17:44:28.452673 systemd[1]: Finished modprobe@dm_mod.service - Load Kernel Module dm_mod. Sep 12 17:44:28.454152 systemd[1]: modprobe@drm.service: Deactivated successfully. Sep 12 17:44:28.454386 systemd[1]: Finished modprobe@drm.service - Load Kernel Module drm. Sep 12 17:44:28.456001 systemd[1]: modprobe@efi_pstore.service: Deactivated successfully. Sep 12 17:44:28.456193 systemd[1]: Finished modprobe@efi_pstore.service - Load Kernel Module efi_pstore. Sep 12 17:44:28.457714 systemd[1]: modprobe@fuse.service: Deactivated successfully. Sep 12 17:44:28.457895 systemd[1]: Finished modprobe@fuse.service - Load Kernel Module fuse. Sep 12 17:44:28.459290 systemd[1]: modprobe@loop.service: Deactivated successfully. Sep 12 17:44:28.459500 systemd[1]: Finished modprobe@loop.service - Load Kernel Module loop. Sep 12 17:44:28.460935 systemd[1]: Finished systemd-modules-load.service - Load Kernel Modules. Sep 12 17:44:28.462394 systemd[1]: Finished systemd-network-generator.service - Generate network units from Kernel command line. Sep 12 17:44:28.463892 systemd[1]: Finished systemd-remount-fs.service - Remount Root and Kernel File Systems. Sep 12 17:44:28.481256 systemd[1]: Reached target network-pre.target - Preparation for Network. Sep 12 17:44:28.492440 systemd[1]: Mounting sys-fs-fuse-connections.mount - FUSE Control File System... Sep 12 17:44:28.494700 systemd[1]: Mounting sys-kernel-config.mount - Kernel Configuration File System... Sep 12 17:44:28.495822 systemd[1]: remount-root.service - Remount Root File System was skipped because of an unmet condition check (ConditionPathIsReadWrite=!/). Sep 12 17:44:28.495850 systemd[1]: Reached target local-fs.target - Local File Systems. Sep 12 17:44:28.497829 systemd[1]: Listening on systemd-sysext.socket - System Extension Image Management (Varlink). Sep 12 17:44:28.500140 systemd[1]: Starting dracut-shutdown.service - Restore /run/initramfs on shutdown... Sep 12 17:44:28.503620 systemd[1]: Starting ldconfig.service - Rebuild Dynamic Linker Cache... Sep 12 17:44:28.504803 systemd[1]: systemd-binfmt.service - Set Up Additional Binary Formats was skipped because no trigger condition checks were met. Sep 12 17:44:28.507505 systemd[1]: Starting systemd-hwdb-update.service - Rebuild Hardware Database... Sep 12 17:44:28.510476 systemd[1]: Starting systemd-journal-flush.service - Flush Journal to Persistent Storage... Sep 12 17:44:28.510980 systemd[1]: systemd-pstore.service - Platform Persistent Storage Archival was skipped because of an unmet condition check (ConditionDirectoryNotEmpty=/sys/fs/pstore). Sep 12 17:44:28.513665 systemd[1]: Starting systemd-random-seed.service - Load/Save OS Random Seed... Sep 12 17:44:28.515333 systemd[1]: systemd-repart.service - Repartition Root Disk was skipped because no trigger condition checks were met. Sep 12 17:44:28.517642 systemd[1]: Starting systemd-sysctl.service - Apply Kernel Variables... Sep 12 17:44:28.531573 systemd-journald[1129]: Time spent on flushing to /var/log/journal/8932748ee4f24fd6a3d8f264c395d347 is 37.214ms for 964 entries. Sep 12 17:44:28.531573 systemd-journald[1129]: System Journal (/var/log/journal/8932748ee4f24fd6a3d8f264c395d347) is 8.0M, max 195.6M, 187.6M free. Sep 12 17:44:28.579599 systemd-journald[1129]: Received client request to flush runtime journal. Sep 12 17:44:28.579642 kernel: loop0: detected capacity change from 0 to 140768 Sep 12 17:44:28.532976 systemd[1]: Starting systemd-sysext.service - Merge System Extension Images into /usr/ and /opt/... Sep 12 17:44:28.552562 systemd[1]: Starting systemd-sysusers.service - Create System Users... Sep 12 17:44:28.557773 systemd[1]: Mounted sys-fs-fuse-connections.mount - FUSE Control File System. Sep 12 17:44:28.560395 systemd[1]: Mounted sys-kernel-config.mount - Kernel Configuration File System. Sep 12 17:44:28.562190 systemd[1]: Finished dracut-shutdown.service - Restore /run/initramfs on shutdown. Sep 12 17:44:28.563800 systemd[1]: Finished systemd-random-seed.service - Load/Save OS Random Seed. Sep 12 17:44:28.565540 systemd[1]: Finished systemd-udev-trigger.service - Coldplug All udev Devices. Sep 12 17:44:28.570674 systemd[1]: Finished systemd-sysctl.service - Apply Kernel Variables. Sep 12 17:44:28.573624 systemd[1]: Reached target first-boot-complete.target - First Boot Complete. Sep 12 17:44:28.582366 kernel: squashfs: version 4.0 (2009/01/31) Phillip Lougher Sep 12 17:44:28.586683 systemd[1]: Starting systemd-machine-id-commit.service - Commit a transient machine-id on disk... Sep 12 17:44:28.590559 systemd[1]: Starting systemd-udev-settle.service - Wait for udev To Complete Device Initialization... Sep 12 17:44:28.593132 systemd[1]: Finished systemd-journal-flush.service - Flush Journal to Persistent Storage. Sep 12 17:44:28.610301 systemd[1]: etc-machine\x2did.mount: Deactivated successfully. Sep 12 17:44:28.611481 systemd[1]: Finished systemd-machine-id-commit.service - Commit a transient machine-id on disk. Sep 12 17:44:28.615906 udevadm[1188]: systemd-udev-settle.service is deprecated. Please fix lvm2-activation.service, lvm2-activation-early.service not to pull it in. Sep 12 17:44:28.617028 systemd[1]: Finished systemd-sysusers.service - Create System Users. Sep 12 17:44:28.623395 kernel: loop1: detected capacity change from 0 to 142488 Sep 12 17:44:28.629409 systemd[1]: Starting systemd-tmpfiles-setup-dev.service - Create Static Device Nodes in /dev... Sep 12 17:44:28.648860 systemd-tmpfiles[1193]: ACLs are not supported, ignoring. Sep 12 17:44:28.648885 systemd-tmpfiles[1193]: ACLs are not supported, ignoring. Sep 12 17:44:28.657175 systemd[1]: Finished systemd-tmpfiles-setup-dev.service - Create Static Device Nodes in /dev. Sep 12 17:44:28.662361 kernel: loop2: detected capacity change from 0 to 140768 Sep 12 17:44:28.684371 kernel: loop3: detected capacity change from 0 to 142488 Sep 12 17:44:28.692084 (sd-merge)[1197]: Using extensions 'containerd-flatcar', 'docker-flatcar'. Sep 12 17:44:28.692608 (sd-merge)[1197]: Merged extensions into '/usr'. Sep 12 17:44:28.697636 systemd[1]: Finished systemd-sysext.service - Merge System Extension Images into /usr/ and /opt/. Sep 12 17:44:28.705602 systemd[1]: Starting ensure-sysext.service... Sep 12 17:44:28.711476 systemd[1]: Starting systemd-tmpfiles-setup.service - Create System Files and Directories... Sep 12 17:44:28.716412 systemd[1]: Reloading requested from client PID 1199 ('systemctl') (unit ensure-sysext.service)... Sep 12 17:44:28.716424 systemd[1]: Reloading... Sep 12 17:44:28.737688 systemd-tmpfiles[1200]: /usr/lib/tmpfiles.d/provision.conf:20: Duplicate line for path "/root", ignoring. Sep 12 17:44:28.738120 systemd-tmpfiles[1200]: /usr/lib/tmpfiles.d/systemd-flatcar.conf:6: Duplicate line for path "/var/log/journal", ignoring. Sep 12 17:44:28.739839 systemd-tmpfiles[1200]: /usr/lib/tmpfiles.d/systemd.conf:29: Duplicate line for path "/var/lib/systemd", ignoring. Sep 12 17:44:28.740289 systemd-tmpfiles[1200]: ACLs are not supported, ignoring. Sep 12 17:44:28.740518 systemd-tmpfiles[1200]: ACLs are not supported, ignoring. Sep 12 17:44:28.746565 systemd-tmpfiles[1200]: Detected autofs mount point /boot during canonicalization of boot. Sep 12 17:44:28.746661 systemd-tmpfiles[1200]: Skipping /boot Sep 12 17:44:28.763994 systemd-tmpfiles[1200]: Detected autofs mount point /boot during canonicalization of boot. Sep 12 17:44:28.764108 systemd-tmpfiles[1200]: Skipping /boot Sep 12 17:44:28.794370 zram_generator::config[1224]: No configuration found. Sep 12 17:44:28.929088 ldconfig[1168]: /sbin/ldconfig: /lib/ld.so.conf is not an ELF file - it has the wrong magic bytes at the start. Sep 12 17:44:28.940874 systemd[1]: /usr/lib/systemd/system/docker.socket:6: ListenStream= references a path below legacy directory /var/run/, updating /var/run/docker.sock → /run/docker.sock; please update the unit file accordingly. Sep 12 17:44:28.990397 systemd[1]: Reloading finished in 273 ms. Sep 12 17:44:29.022417 systemd[1]: Finished ldconfig.service - Rebuild Dynamic Linker Cache. Sep 12 17:44:29.031897 systemd[1]: Finished systemd-tmpfiles-setup.service - Create System Files and Directories. Sep 12 17:44:29.051752 systemd[1]: Starting audit-rules.service - Load Security Auditing Rules... Sep 12 17:44:29.055455 systemd[1]: Starting clean-ca-certificates.service - Clean up broken links in /etc/ssl/certs... Sep 12 17:44:29.060612 systemd[1]: Starting systemd-journal-catalog-update.service - Rebuild Journal Catalog... Sep 12 17:44:29.068749 systemd[1]: Starting systemd-resolved.service - Network Name Resolution... Sep 12 17:44:29.078364 systemd[1]: Starting systemd-update-utmp.service - Record System Boot/Shutdown in UTMP... Sep 12 17:44:29.082758 systemd[1]: proc-xen.mount - /proc/xen was skipped because of an unmet condition check (ConditionVirtualization=xen). Sep 12 17:44:29.082987 systemd[1]: ignition-delete-config.service - Ignition (delete config) was skipped because no trigger condition checks were met. Sep 12 17:44:29.084579 systemd[1]: Starting modprobe@dm_mod.service - Load Kernel Module dm_mod... Sep 12 17:44:29.091479 systemd[1]: Starting modprobe@efi_pstore.service - Load Kernel Module efi_pstore... Sep 12 17:44:29.094569 systemd[1]: Starting modprobe@loop.service - Load Kernel Module loop... Sep 12 17:44:29.096212 systemd[1]: systemd-binfmt.service - Set Up Additional Binary Formats was skipped because no trigger condition checks were met. Sep 12 17:44:29.106123 systemd[1]: Starting systemd-userdbd.service - User Database Manager... Sep 12 17:44:29.107855 systemd[1]: xenserver-pv-version.service - Set fake PV driver version for XenServer was skipped because of an unmet condition check (ConditionVirtualization=xen). Sep 12 17:44:29.110282 systemd[1]: Finished systemd-journal-catalog-update.service - Rebuild Journal Catalog. Sep 12 17:44:29.114188 systemd[1]: modprobe@dm_mod.service: Deactivated successfully. Sep 12 17:44:29.114407 systemd[1]: Finished modprobe@dm_mod.service - Load Kernel Module dm_mod. Sep 12 17:44:29.116253 systemd[1]: modprobe@efi_pstore.service: Deactivated successfully. Sep 12 17:44:29.116478 systemd[1]: Finished modprobe@efi_pstore.service - Load Kernel Module efi_pstore. Sep 12 17:44:29.118742 systemd[1]: modprobe@loop.service: Deactivated successfully. Sep 12 17:44:29.119168 systemd[1]: Finished modprobe@loop.service - Load Kernel Module loop. Sep 12 17:44:29.123819 augenrules[1290]: No rules Sep 12 17:44:29.126831 systemd[1]: Finished audit-rules.service - Load Security Auditing Rules. Sep 12 17:44:29.132258 systemd[1]: proc-xen.mount - /proc/xen was skipped because of an unmet condition check (ConditionVirtualization=xen). Sep 12 17:44:29.134206 systemd[1]: ignition-delete-config.service - Ignition (delete config) was skipped because no trigger condition checks were met. Sep 12 17:44:29.141603 systemd[1]: Starting modprobe@dm_mod.service - Load Kernel Module dm_mod... Sep 12 17:44:29.144210 systemd[1]: Starting modprobe@efi_pstore.service - Load Kernel Module efi_pstore... Sep 12 17:44:29.151465 systemd[1]: Starting modprobe@loop.service - Load Kernel Module loop... Sep 12 17:44:29.153085 systemd[1]: systemd-binfmt.service - Set Up Additional Binary Formats was skipped because no trigger condition checks were met. Sep 12 17:44:29.153222 systemd[1]: xenserver-pv-version.service - Set fake PV driver version for XenServer was skipped because of an unmet condition check (ConditionVirtualization=xen). Sep 12 17:44:29.154710 systemd[1]: Finished systemd-update-utmp.service - Record System Boot/Shutdown in UTMP. Sep 12 17:44:29.157454 systemd[1]: modprobe@dm_mod.service: Deactivated successfully. Sep 12 17:44:29.157763 systemd[1]: Finished modprobe@dm_mod.service - Load Kernel Module dm_mod. Sep 12 17:44:29.160050 systemd[1]: modprobe@efi_pstore.service: Deactivated successfully. Sep 12 17:44:29.160245 systemd[1]: Finished modprobe@efi_pstore.service - Load Kernel Module efi_pstore. Sep 12 17:44:29.162891 systemd[1]: modprobe@loop.service: Deactivated successfully. Sep 12 17:44:29.163191 systemd[1]: Finished modprobe@loop.service - Load Kernel Module loop. Sep 12 17:44:29.168212 systemd[1]: Started systemd-userdbd.service - User Database Manager. Sep 12 17:44:29.170000 systemd[1]: Finished clean-ca-certificates.service - Clean up broken links in /etc/ssl/certs. Sep 12 17:44:29.178308 systemd[1]: proc-xen.mount - /proc/xen was skipped because of an unmet condition check (ConditionVirtualization=xen). Sep 12 17:44:29.178570 systemd[1]: ignition-delete-config.service - Ignition (delete config) was skipped because no trigger condition checks were met. Sep 12 17:44:29.179960 systemd[1]: Starting modprobe@dm_mod.service - Load Kernel Module dm_mod... Sep 12 17:44:29.196029 systemd[1]: Starting modprobe@drm.service - Load Kernel Module drm... Sep 12 17:44:29.200443 systemd[1]: Starting modprobe@efi_pstore.service - Load Kernel Module efi_pstore... Sep 12 17:44:29.207436 systemd[1]: Starting modprobe@loop.service - Load Kernel Module loop... Sep 12 17:44:29.208748 systemd[1]: systemd-binfmt.service - Set Up Additional Binary Formats was skipped because no trigger condition checks were met. Sep 12 17:44:29.208947 systemd[1]: update-ca-certificates.service - Update CA bundle at /etc/ssl/certs/ca-certificates.crt was skipped because of an unmet condition check (ConditionPathIsSymbolicLink=!/etc/ssl/certs/ca-certificates.crt). Sep 12 17:44:29.209060 systemd[1]: xenserver-pv-version.service - Set fake PV driver version for XenServer was skipped because of an unmet condition check (ConditionVirtualization=xen). Sep 12 17:44:29.211221 systemd[1]: modprobe@dm_mod.service: Deactivated successfully. Sep 12 17:44:29.211800 systemd[1]: Finished modprobe@dm_mod.service - Load Kernel Module dm_mod. Sep 12 17:44:29.213838 systemd[1]: modprobe@drm.service: Deactivated successfully. Sep 12 17:44:29.214141 systemd[1]: Finished modprobe@drm.service - Load Kernel Module drm. Sep 12 17:44:29.215923 systemd[1]: modprobe@efi_pstore.service: Deactivated successfully. Sep 12 17:44:29.216291 systemd[1]: Finished modprobe@efi_pstore.service - Load Kernel Module efi_pstore. Sep 12 17:44:29.220527 systemd[1]: Finished ensure-sysext.service. Sep 12 17:44:29.222145 systemd[1]: modprobe@loop.service: Deactivated successfully. Sep 12 17:44:29.222395 systemd[1]: Finished modprobe@loop.service - Load Kernel Module loop. Sep 12 17:44:29.227880 systemd[1]: systemd-pstore.service - Platform Persistent Storage Archival was skipped because of an unmet condition check (ConditionDirectoryNotEmpty=/sys/fs/pstore). Sep 12 17:44:29.227966 systemd[1]: systemd-repart.service - Repartition Root Disk was skipped because no trigger condition checks were met. Sep 12 17:44:29.238418 systemd[1]: Starting systemd-timesyncd.service - Network Time Synchronization... Sep 12 17:44:29.244816 systemd-resolved[1276]: Positive Trust Anchors: Sep 12 17:44:29.244831 systemd-resolved[1276]: . IN DS 20326 8 2 e06d44b80b8f1d39a95c0b0d7c65d08458e880409bbc683457104237c7f8ec8d Sep 12 17:44:29.244862 systemd-resolved[1276]: Negative trust anchors: home.arpa 10.in-addr.arpa 16.172.in-addr.arpa 17.172.in-addr.arpa 18.172.in-addr.arpa 19.172.in-addr.arpa 20.172.in-addr.arpa 21.172.in-addr.arpa 22.172.in-addr.arpa 23.172.in-addr.arpa 24.172.in-addr.arpa 25.172.in-addr.arpa 26.172.in-addr.arpa 27.172.in-addr.arpa 28.172.in-addr.arpa 29.172.in-addr.arpa 30.172.in-addr.arpa 31.172.in-addr.arpa 170.0.0.192.in-addr.arpa 171.0.0.192.in-addr.arpa 168.192.in-addr.arpa d.f.ip6.arpa ipv4only.arpa resolver.arpa corp home internal intranet lan local private test Sep 12 17:44:29.248548 systemd-resolved[1276]: Defaulting to hostname 'linux'. Sep 12 17:44:29.250243 systemd[1]: Started systemd-resolved.service - Network Name Resolution. Sep 12 17:44:29.251607 systemd[1]: Reached target nss-lookup.target - Host and Network Name Lookups. Sep 12 17:44:29.300651 systemd[1]: Started systemd-timesyncd.service - Network Time Synchronization. Sep 12 17:44:29.302069 systemd[1]: Reached target time-set.target - System Time Set. Sep 12 17:44:29.340083 systemd[1]: Finished systemd-hwdb-update.service - Rebuild Hardware Database. Sep 12 17:44:29.349743 systemd[1]: Starting systemd-udevd.service - Rule-based Manager for Device Events and Files... Sep 12 17:44:29.352381 systemd[1]: Starting systemd-update-done.service - Update is Completed... Sep 12 17:44:29.372626 systemd[1]: Finished systemd-update-done.service - Update is Completed. Sep 12 17:44:29.385494 systemd-udevd[1325]: Using default interface naming scheme 'v255'. Sep 12 17:44:29.408474 systemd[1]: Started systemd-udevd.service - Rule-based Manager for Device Events and Files. Sep 12 17:44:29.417517 systemd[1]: Starting systemd-networkd.service - Network Configuration... Sep 12 17:44:29.458950 systemd[1]: Condition check resulted in dev-ttyS0.device - /dev/ttyS0 being skipped. Sep 12 17:44:29.466527 kernel: BTRFS warning: duplicate device /dev/vda3 devid 1 generation 34 scanned by (udev-worker) (1342) Sep 12 17:44:29.475475 systemd-networkd[1333]: lo: Link UP Sep 12 17:44:29.475486 systemd-networkd[1333]: lo: Gained carrier Sep 12 17:44:29.478724 systemd-networkd[1333]: Enumeration completed Sep 12 17:44:29.478915 systemd[1]: Started systemd-networkd.service - Network Configuration. Sep 12 17:44:29.480570 systemd-networkd[1333]: eth0: found matching network '/usr/lib/systemd/network/zz-default.network', based on potentially unpredictable interface name. Sep 12 17:44:29.480634 systemd-networkd[1333]: eth0: Configuring with /usr/lib/systemd/network/zz-default.network. Sep 12 17:44:29.482747 systemd-networkd[1333]: eth0: Link UP Sep 12 17:44:29.482800 systemd-networkd[1333]: eth0: Gained carrier Sep 12 17:44:29.483053 systemd[1]: Reached target network.target - Network. Sep 12 17:44:29.483129 systemd-networkd[1333]: eth0: found matching network '/usr/lib/systemd/network/zz-default.network', based on potentially unpredictable interface name. Sep 12 17:44:29.491504 systemd[1]: Starting systemd-networkd-wait-online.service - Wait for Network to be Configured... Sep 12 17:44:29.499486 systemd-networkd[1333]: eth0: DHCPv4 address 10.0.0.158/16, gateway 10.0.0.1 acquired from 10.0.0.1 Sep 12 17:44:29.502060 systemd-timesyncd[1322]: Network configuration changed, trying to establish connection. Sep 12 17:44:30.017197 systemd-timesyncd[1322]: Contacted time server 10.0.0.1:123 (10.0.0.1). Sep 12 17:44:30.017377 systemd-timesyncd[1322]: Initial clock synchronization to Fri 2025-09-12 17:44:30.017101 UTC. Sep 12 17:44:30.017521 systemd-resolved[1276]: Clock change detected. Flushing caches. Sep 12 17:44:30.027878 systemd-networkd[1333]: eth0: found matching network '/usr/lib/systemd/network/zz-default.network', based on potentially unpredictable interface name. Sep 12 17:44:30.031338 systemd[1]: Found device dev-disk-by\x2dlabel-OEM.device - /dev/disk/by-label/OEM. Sep 12 17:44:30.036889 kernel: input: Power Button as /devices/LNXSYSTM:00/LNXPWRBN:00/input/input2 Sep 12 17:44:30.040075 systemd[1]: Starting systemd-fsck@dev-disk-by\x2dlabel-OEM.service - File System Check on /dev/disk/by-label/OEM... Sep 12 17:44:30.045947 kernel: ACPI: button: Power Button [PWRF] Sep 12 17:44:30.050367 kernel: i801_smbus 0000:00:1f.3: Enabling SMBus device Sep 12 17:44:30.050690 kernel: i801_smbus 0000:00:1f.3: SMBus using PCI interrupt Sep 12 17:44:30.051222 kernel: i2c i2c-0: 1/1 memory slots populated (from DMI) Sep 12 17:44:30.051444 kernel: i2c i2c-0: Memory type 0x07 not supported yet, not instantiating SPD Sep 12 17:44:30.052085 systemd[1]: Finished systemd-fsck@dev-disk-by\x2dlabel-OEM.service - File System Check on /dev/disk/by-label/OEM. Sep 12 17:44:30.064868 kernel: input: ImExPS/2 Generic Explorer Mouse as /devices/platform/i8042/serio1/input/input3 Sep 12 17:44:30.108818 kernel: mousedev: PS/2 mouse device common for all mice Sep 12 17:44:30.112176 systemd[1]: Starting systemd-vconsole-setup.service - Virtual Console Setup... Sep 12 17:44:30.124323 systemd[1]: systemd-vconsole-setup.service: Deactivated successfully. Sep 12 17:44:30.124651 systemd[1]: Stopped systemd-vconsole-setup.service - Virtual Console Setup. Sep 12 17:44:30.129756 systemd[1]: Starting systemd-vconsole-setup.service - Virtual Console Setup... Sep 12 17:44:30.190248 kernel: kvm_amd: TSC scaling supported Sep 12 17:44:30.190335 kernel: kvm_amd: Nested Virtualization enabled Sep 12 17:44:30.190404 kernel: kvm_amd: Nested Paging enabled Sep 12 17:44:30.190418 kernel: kvm_amd: LBR virtualization supported Sep 12 17:44:30.190925 kernel: kvm_amd: Virtual VMLOAD VMSAVE supported Sep 12 17:44:30.192193 kernel: kvm_amd: Virtual GIF supported Sep 12 17:44:30.211866 kernel: EDAC MC: Ver: 3.0.0 Sep 12 17:44:30.226044 systemd[1]: Finished systemd-vconsole-setup.service - Virtual Console Setup. Sep 12 17:44:30.243066 systemd[1]: Finished systemd-udev-settle.service - Wait for udev To Complete Device Initialization. Sep 12 17:44:30.256128 systemd[1]: Starting lvm2-activation-early.service - Activation of LVM2 logical volumes... Sep 12 17:44:30.265489 lvm[1376]: WARNING: Failed to connect to lvmetad. Falling back to device scanning. Sep 12 17:44:30.310408 systemd[1]: Finished lvm2-activation-early.service - Activation of LVM2 logical volumes. Sep 12 17:44:30.312080 systemd[1]: Reached target cryptsetup.target - Local Encrypted Volumes. Sep 12 17:44:30.313277 systemd[1]: Reached target sysinit.target - System Initialization. Sep 12 17:44:30.314575 systemd[1]: Started motdgen.path - Watch for update engine configuration changes. Sep 12 17:44:30.315896 systemd[1]: Started user-cloudinit@var-lib-flatcar\x2dinstall-user_data.path - Watch for a cloud-config at /var/lib/flatcar-install/user_data. Sep 12 17:44:30.317341 systemd[1]: Started logrotate.timer - Daily rotation of log files. Sep 12 17:44:30.318595 systemd[1]: Started mdadm.timer - Weekly check for MD array's redundancy information.. Sep 12 17:44:30.319911 systemd[1]: Started systemd-tmpfiles-clean.timer - Daily Cleanup of Temporary Directories. Sep 12 17:44:30.321173 systemd[1]: update-engine-stub.timer - Update Engine Stub Timer was skipped because of an unmet condition check (ConditionPathExists=/usr/.noupdate). Sep 12 17:44:30.321211 systemd[1]: Reached target paths.target - Path Units. Sep 12 17:44:30.322152 systemd[1]: Reached target timers.target - Timer Units. Sep 12 17:44:30.324076 systemd[1]: Listening on dbus.socket - D-Bus System Message Bus Socket. Sep 12 17:44:30.327362 systemd[1]: Starting docker.socket - Docker Socket for the API... Sep 12 17:44:30.339372 systemd[1]: Listening on sshd.socket - OpenSSH Server Socket. Sep 12 17:44:30.341810 systemd[1]: Starting lvm2-activation.service - Activation of LVM2 logical volumes... Sep 12 17:44:30.343517 systemd[1]: Listening on docker.socket - Docker Socket for the API. Sep 12 17:44:30.344782 systemd[1]: Reached target sockets.target - Socket Units. Sep 12 17:44:30.345833 systemd[1]: Reached target basic.target - Basic System. Sep 12 17:44:30.346893 systemd[1]: addon-config@oem.service - Configure Addon /oem was skipped because no trigger condition checks were met. Sep 12 17:44:30.346931 systemd[1]: addon-run@oem.service - Run Addon /oem was skipped because no trigger condition checks were met. Sep 12 17:44:30.347943 systemd[1]: Starting containerd.service - containerd container runtime... Sep 12 17:44:30.350333 systemd[1]: Starting dbus.service - D-Bus System Message Bus... Sep 12 17:44:30.355001 systemd[1]: Starting enable-oem-cloudinit.service - Enable cloudinit... Sep 12 17:44:30.357248 systemd[1]: Starting extend-filesystems.service - Extend Filesystems... Sep 12 17:44:30.358393 systemd[1]: flatcar-setup-environment.service - Modifies /etc/environment for CoreOS was skipped because of an unmet condition check (ConditionPathExists=/oem/bin/flatcar-setup-environment). Sep 12 17:44:30.361007 systemd[1]: Starting motdgen.service - Generate /run/flatcar/motd... Sep 12 17:44:30.367975 jq[1383]: false Sep 12 17:44:30.368236 lvm[1380]: WARNING: Failed to connect to lvmetad. Falling back to device scanning. Sep 12 17:44:30.365446 systemd[1]: Starting ssh-key-proc-cmdline.service - Install an ssh key from /proc/cmdline... Sep 12 17:44:30.380110 systemd[1]: Starting sshd-keygen.service - Generate sshd host keys... Sep 12 17:44:30.380336 dbus-daemon[1382]: [system] SELinux support is enabled Sep 12 17:44:30.384544 extend-filesystems[1384]: Found loop2 Sep 12 17:44:30.384544 extend-filesystems[1384]: Found loop3 Sep 12 17:44:30.384544 extend-filesystems[1384]: Found sr0 Sep 12 17:44:30.384544 extend-filesystems[1384]: Found vda Sep 12 17:44:30.384544 extend-filesystems[1384]: Found vda1 Sep 12 17:44:30.384544 extend-filesystems[1384]: Found vda2 Sep 12 17:44:30.384544 extend-filesystems[1384]: Found vda3 Sep 12 17:44:30.384544 extend-filesystems[1384]: Found usr Sep 12 17:44:30.384544 extend-filesystems[1384]: Found vda4 Sep 12 17:44:30.384544 extend-filesystems[1384]: Found vda6 Sep 12 17:44:30.384544 extend-filesystems[1384]: Found vda7 Sep 12 17:44:30.384544 extend-filesystems[1384]: Found vda9 Sep 12 17:44:30.384544 extend-filesystems[1384]: Checking size of /dev/vda9 Sep 12 17:44:30.385513 systemd[1]: Starting systemd-logind.service - User Login Management... Sep 12 17:44:30.410213 extend-filesystems[1384]: Old size kept for /dev/vda9 Sep 12 17:44:30.390480 systemd[1]: tcsd.service - TCG Core Services Daemon was skipped because of an unmet condition check (ConditionPathExists=/dev/tpm0). Sep 12 17:44:30.391009 systemd[1]: cgroup compatibility translation between legacy and unified hierarchy settings activated. See cgroup-compat debug messages for details. Sep 12 17:44:30.396071 systemd[1]: Starting update-engine.service - Update Engine... Sep 12 17:44:30.411885 jq[1401]: true Sep 12 17:44:30.402855 systemd[1]: Starting update-ssh-keys-after-ignition.service - Run update-ssh-keys once after Ignition... Sep 12 17:44:30.409021 systemd[1]: Started dbus.service - D-Bus System Message Bus. Sep 12 17:44:30.415231 systemd[1]: Finished lvm2-activation.service - Activation of LVM2 logical volumes. Sep 12 17:44:30.418159 systemd[1]: enable-oem-cloudinit.service: Skipped due to 'exec-condition'. Sep 12 17:44:30.418430 systemd[1]: Condition check resulted in enable-oem-cloudinit.service - Enable cloudinit being skipped. Sep 12 17:44:30.418824 systemd[1]: extend-filesystems.service: Deactivated successfully. Sep 12 17:44:30.419466 systemd[1]: Finished extend-filesystems.service - Extend Filesystems. Sep 12 17:44:30.421474 systemd[1]: motdgen.service: Deactivated successfully. Sep 12 17:44:30.421734 systemd[1]: Finished motdgen.service - Generate /run/flatcar/motd. Sep 12 17:44:30.423298 systemd[1]: ssh-key-proc-cmdline.service: Deactivated successfully. Sep 12 17:44:30.423553 systemd[1]: Finished ssh-key-proc-cmdline.service - Install an ssh key from /proc/cmdline. Sep 12 17:44:30.431354 update_engine[1393]: I20250912 17:44:30.431026 1393 main.cc:92] Flatcar Update Engine starting Sep 12 17:44:30.440016 jq[1405]: true Sep 12 17:44:30.440257 update_engine[1393]: I20250912 17:44:30.437425 1393 update_check_scheduler.cc:74] Next update check in 2m19s Sep 12 17:44:30.442596 kernel: BTRFS warning: duplicate device /dev/vda3 devid 1 generation 34 scanned by (udev-worker) (1329) Sep 12 17:44:30.461781 systemd-logind[1390]: Watching system buttons on /dev/input/event1 (Power Button) Sep 12 17:44:30.461811 systemd-logind[1390]: Watching system buttons on /dev/input/event0 (AT Translated Set 2 keyboard) Sep 12 17:44:30.462740 systemd-logind[1390]: New seat seat0. Sep 12 17:44:30.467324 (ntainerd)[1414]: containerd.service: Referenced but unset environment variable evaluates to an empty string: TORCX_IMAGEDIR, TORCX_UNPACKDIR Sep 12 17:44:30.467532 systemd[1]: Started systemd-logind.service - User Login Management. Sep 12 17:44:30.475992 systemd[1]: Started update-engine.service - Update Engine. Sep 12 17:44:30.478073 systemd[1]: system-cloudinit@usr-share-oem-cloud\x2dconfig.yml.service - Load cloud-config from /usr/share/oem/cloud-config.yml was skipped because of an unmet condition check (ConditionFileNotEmpty=/usr/share/oem/cloud-config.yml). Sep 12 17:44:30.478218 systemd[1]: Reached target system-config.target - Load system-provided cloud configs. Sep 12 17:44:30.479980 systemd[1]: user-cloudinit-proc-cmdline.service - Load cloud-config from url defined in /proc/cmdline was skipped because of an unmet condition check (ConditionKernelCommandLine=cloud-config-url). Sep 12 17:44:30.480087 systemd[1]: Reached target user-config.target - Load user-provided cloud configs. Sep 12 17:44:30.490102 systemd[1]: Started locksmithd.service - Cluster reboot manager. Sep 12 17:44:30.519229 locksmithd[1431]: locksmithd starting currentOperation="UPDATE_STATUS_IDLE" strategy="reboot" Sep 12 17:44:30.520122 bash[1432]: Updated "/home/core/.ssh/authorized_keys" Sep 12 17:44:30.521274 systemd[1]: Finished update-ssh-keys-after-ignition.service - Run update-ssh-keys once after Ignition. Sep 12 17:44:30.524048 systemd[1]: sshkeys.service was skipped because no trigger condition checks were met. Sep 12 17:44:30.679303 containerd[1414]: time="2025-09-12T17:44:30.679202759Z" level=info msg="starting containerd" revision=174e0d1785eeda18dc2beba45e1d5a188771636b version=v1.7.21 Sep 12 17:44:30.703360 containerd[1414]: time="2025-09-12T17:44:30.703317271Z" level=info msg="loading plugin \"io.containerd.snapshotter.v1.aufs\"..." type=io.containerd.snapshotter.v1 Sep 12 17:44:30.705446 containerd[1414]: time="2025-09-12T17:44:30.705390580Z" level=info msg="skip loading plugin \"io.containerd.snapshotter.v1.aufs\"..." error="aufs is not supported (modprobe aufs failed: exit status 1 \"modprobe: FATAL: Module aufs not found in directory /lib/modules/6.6.106-flatcar\\n\"): skip plugin" type=io.containerd.snapshotter.v1 Sep 12 17:44:30.705446 containerd[1414]: time="2025-09-12T17:44:30.705428722Z" level=info msg="loading plugin \"io.containerd.event.v1.exchange\"..." type=io.containerd.event.v1 Sep 12 17:44:30.705446 containerd[1414]: time="2025-09-12T17:44:30.705447106Z" level=info msg="loading plugin \"io.containerd.internal.v1.opt\"..." type=io.containerd.internal.v1 Sep 12 17:44:30.705651 containerd[1414]: time="2025-09-12T17:44:30.705620712Z" level=info msg="loading plugin \"io.containerd.warning.v1.deprecations\"..." type=io.containerd.warning.v1 Sep 12 17:44:30.705651 containerd[1414]: time="2025-09-12T17:44:30.705646921Z" level=info msg="loading plugin \"io.containerd.snapshotter.v1.blockfile\"..." type=io.containerd.snapshotter.v1 Sep 12 17:44:30.705744 containerd[1414]: time="2025-09-12T17:44:30.705721771Z" level=info msg="skip loading plugin \"io.containerd.snapshotter.v1.blockfile\"..." error="no scratch file generator: skip plugin" type=io.containerd.snapshotter.v1 Sep 12 17:44:30.705771 containerd[1414]: time="2025-09-12T17:44:30.705743803Z" level=info msg="loading plugin \"io.containerd.snapshotter.v1.btrfs\"..." type=io.containerd.snapshotter.v1 Sep 12 17:44:30.705994 containerd[1414]: time="2025-09-12T17:44:30.705959527Z" 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 Sep 12 17:44:30.705994 containerd[1414]: time="2025-09-12T17:44:30.705983953Z" level=info msg="loading plugin \"io.containerd.snapshotter.v1.devmapper\"..." type=io.containerd.snapshotter.v1 Sep 12 17:44:30.706042 containerd[1414]: time="2025-09-12T17:44:30.706001446Z" level=info msg="skip loading plugin \"io.containerd.snapshotter.v1.devmapper\"..." error="devmapper not configured: skip plugin" type=io.containerd.snapshotter.v1 Sep 12 17:44:30.706042 containerd[1414]: time="2025-09-12T17:44:30.706016073Z" level=info msg="loading plugin \"io.containerd.snapshotter.v1.native\"..." type=io.containerd.snapshotter.v1 Sep 12 17:44:30.706160 containerd[1414]: time="2025-09-12T17:44:30.706138463Z" level=info msg="loading plugin \"io.containerd.snapshotter.v1.overlayfs\"..." type=io.containerd.snapshotter.v1 Sep 12 17:44:30.706619 containerd[1414]: time="2025-09-12T17:44:30.706561536Z" level=info msg="loading plugin \"io.containerd.snapshotter.v1.zfs\"..." type=io.containerd.snapshotter.v1 Sep 12 17:44:30.706890 containerd[1414]: time="2025-09-12T17:44:30.706867530Z" 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 Sep 12 17:44:30.706890 containerd[1414]: time="2025-09-12T17:44:30.706887508Z" level=info msg="loading plugin \"io.containerd.content.v1.content\"..." type=io.containerd.content.v1 Sep 12 17:44:30.707081 containerd[1414]: time="2025-09-12T17:44:30.707062426Z" level=info msg="loading plugin \"io.containerd.metadata.v1.bolt\"..." type=io.containerd.metadata.v1 Sep 12 17:44:30.707145 containerd[1414]: time="2025-09-12T17:44:30.707127618Z" level=info msg="metadata content store policy set" policy=shared Sep 12 17:44:30.713645 containerd[1414]: time="2025-09-12T17:44:30.713585401Z" level=info msg="loading plugin \"io.containerd.gc.v1.scheduler\"..." type=io.containerd.gc.v1 Sep 12 17:44:30.713683 containerd[1414]: time="2025-09-12T17:44:30.713664409Z" level=info msg="loading plugin \"io.containerd.differ.v1.walking\"..." type=io.containerd.differ.v1 Sep 12 17:44:30.713706 containerd[1414]: time="2025-09-12T17:44:30.713682784Z" level=info msg="loading plugin \"io.containerd.lease.v1.manager\"..." type=io.containerd.lease.v1 Sep 12 17:44:30.713706 containerd[1414]: time="2025-09-12T17:44:30.713699415Z" level=info msg="loading plugin \"io.containerd.streaming.v1.manager\"..." type=io.containerd.streaming.v1 Sep 12 17:44:30.713762 containerd[1414]: time="2025-09-12T17:44:30.713714393Z" level=info msg="loading plugin \"io.containerd.runtime.v1.linux\"..." type=io.containerd.runtime.v1 Sep 12 17:44:30.713910 containerd[1414]: time="2025-09-12T17:44:30.713888460Z" level=info msg="loading plugin \"io.containerd.monitor.v1.cgroups\"..." type=io.containerd.monitor.v1 Sep 12 17:44:30.714181 containerd[1414]: time="2025-09-12T17:44:30.714158055Z" level=info msg="loading plugin \"io.containerd.runtime.v2.task\"..." type=io.containerd.runtime.v2 Sep 12 17:44:30.714296 containerd[1414]: time="2025-09-12T17:44:30.714276247Z" level=info msg="loading plugin \"io.containerd.runtime.v2.shim\"..." type=io.containerd.runtime.v2 Sep 12 17:44:30.714320 containerd[1414]: time="2025-09-12T17:44:30.714293980Z" level=info msg="loading plugin \"io.containerd.sandbox.store.v1.local\"..." type=io.containerd.sandbox.store.v1 Sep 12 17:44:30.714320 containerd[1414]: time="2025-09-12T17:44:30.714308247Z" level=info msg="loading plugin \"io.containerd.sandbox.controller.v1.local\"..." type=io.containerd.sandbox.controller.v1 Sep 12 17:44:30.714381 containerd[1414]: time="2025-09-12T17:44:30.714322133Z" level=info msg="loading plugin \"io.containerd.service.v1.containers-service\"..." type=io.containerd.service.v1 Sep 12 17:44:30.714381 containerd[1414]: time="2025-09-12T17:44:30.714335087Z" level=info msg="loading plugin \"io.containerd.service.v1.content-service\"..." type=io.containerd.service.v1 Sep 12 17:44:30.714381 containerd[1414]: time="2025-09-12T17:44:30.714347160Z" level=info msg="loading plugin \"io.containerd.service.v1.diff-service\"..." type=io.containerd.service.v1 Sep 12 17:44:30.714381 containerd[1414]: time="2025-09-12T17:44:30.714361146Z" level=info msg="loading plugin \"io.containerd.service.v1.images-service\"..." type=io.containerd.service.v1 Sep 12 17:44:30.714462 containerd[1414]: time="2025-09-12T17:44:30.714387846Z" level=info msg="loading plugin \"io.containerd.service.v1.introspection-service\"..." type=io.containerd.service.v1 Sep 12 17:44:30.714462 containerd[1414]: time="2025-09-12T17:44:30.714403826Z" level=info msg="loading plugin \"io.containerd.service.v1.namespaces-service\"..." type=io.containerd.service.v1 Sep 12 17:44:30.714462 containerd[1414]: time="2025-09-12T17:44:30.714417482Z" level=info msg="loading plugin \"io.containerd.service.v1.snapshots-service\"..." type=io.containerd.service.v1 Sep 12 17:44:30.714462 containerd[1414]: time="2025-09-12T17:44:30.714429945Z" level=info msg="loading plugin \"io.containerd.service.v1.tasks-service\"..." type=io.containerd.service.v1 Sep 12 17:44:30.714462 containerd[1414]: time="2025-09-12T17:44:30.714450845Z" level=info msg="loading plugin \"io.containerd.grpc.v1.containers\"..." type=io.containerd.grpc.v1 Sep 12 17:44:30.714565 containerd[1414]: time="2025-09-12T17:44:30.714464129Z" level=info msg="loading plugin \"io.containerd.grpc.v1.content\"..." type=io.containerd.grpc.v1 Sep 12 17:44:30.714565 containerd[1414]: time="2025-09-12T17:44:30.714476543Z" level=info msg="loading plugin \"io.containerd.grpc.v1.diff\"..." type=io.containerd.grpc.v1 Sep 12 17:44:30.714565 containerd[1414]: time="2025-09-12T17:44:30.714493004Z" level=info msg="loading plugin \"io.containerd.grpc.v1.events\"..." type=io.containerd.grpc.v1 Sep 12 17:44:30.714565 containerd[1414]: time="2025-09-12T17:44:30.714506228Z" level=info msg="loading plugin \"io.containerd.grpc.v1.images\"..." type=io.containerd.grpc.v1 Sep 12 17:44:30.714565 containerd[1414]: time="2025-09-12T17:44:30.714519463Z" level=info msg="loading plugin \"io.containerd.grpc.v1.introspection\"..." type=io.containerd.grpc.v1 Sep 12 17:44:30.714565 containerd[1414]: time="2025-09-12T17:44:30.714532949Z" level=info msg="loading plugin \"io.containerd.grpc.v1.leases\"..." type=io.containerd.grpc.v1 Sep 12 17:44:30.714565 containerd[1414]: time="2025-09-12T17:44:30.714548979Z" level=info msg="loading plugin \"io.containerd.grpc.v1.namespaces\"..." type=io.containerd.grpc.v1 Sep 12 17:44:30.714565 containerd[1414]: time="2025-09-12T17:44:30.714564247Z" level=info msg="loading plugin \"io.containerd.grpc.v1.sandbox-controllers\"..." type=io.containerd.grpc.v1 Sep 12 17:44:30.714740 containerd[1414]: time="2025-09-12T17:44:30.714581981Z" level=info msg="loading plugin \"io.containerd.grpc.v1.sandboxes\"..." type=io.containerd.grpc.v1 Sep 12 17:44:30.714740 containerd[1414]: time="2025-09-12T17:44:30.714596538Z" level=info msg="loading plugin \"io.containerd.grpc.v1.snapshots\"..." type=io.containerd.grpc.v1 Sep 12 17:44:30.714740 containerd[1414]: time="2025-09-12T17:44:30.714614211Z" level=info msg="loading plugin \"io.containerd.grpc.v1.streaming\"..." type=io.containerd.grpc.v1 Sep 12 17:44:30.714740 containerd[1414]: time="2025-09-12T17:44:30.714637194Z" level=info msg="loading plugin \"io.containerd.grpc.v1.tasks\"..." type=io.containerd.grpc.v1 Sep 12 17:44:30.714740 containerd[1414]: time="2025-09-12T17:44:30.714657793Z" level=info msg="loading plugin \"io.containerd.transfer.v1.local\"..." type=io.containerd.transfer.v1 Sep 12 17:44:30.714740 containerd[1414]: time="2025-09-12T17:44:30.714681277Z" level=info msg="loading plugin \"io.containerd.grpc.v1.transfer\"..." type=io.containerd.grpc.v1 Sep 12 17:44:30.714740 containerd[1414]: time="2025-09-12T17:44:30.714695894Z" level=info msg="loading plugin \"io.containerd.grpc.v1.version\"..." type=io.containerd.grpc.v1 Sep 12 17:44:30.714740 containerd[1414]: time="2025-09-12T17:44:30.714709770Z" level=info msg="loading plugin \"io.containerd.internal.v1.restart\"..." type=io.containerd.internal.v1 Sep 12 17:44:30.714924 containerd[1414]: time="2025-09-12T17:44:30.714772037Z" level=info msg="loading plugin \"io.containerd.tracing.processor.v1.otlp\"..." type=io.containerd.tracing.processor.v1 Sep 12 17:44:30.714924 containerd[1414]: time="2025-09-12T17:44:30.714796593Z" level=info msg="skip loading plugin \"io.containerd.tracing.processor.v1.otlp\"..." error="skip plugin: tracing endpoint not configured" type=io.containerd.tracing.processor.v1 Sep 12 17:44:30.714924 containerd[1414]: time="2025-09-12T17:44:30.714811441Z" level=info msg="loading plugin \"io.containerd.internal.v1.tracing\"..." type=io.containerd.internal.v1 Sep 12 17:44:30.714924 containerd[1414]: time="2025-09-12T17:44:30.714826108Z" level=info msg="skip loading plugin \"io.containerd.internal.v1.tracing\"..." error="skip plugin: tracing endpoint not configured" type=io.containerd.internal.v1 Sep 12 17:44:30.714924 containerd[1414]: time="2025-09-12T17:44:30.714856205Z" level=info msg="loading plugin \"io.containerd.grpc.v1.healthcheck\"..." type=io.containerd.grpc.v1 Sep 12 17:44:30.714924 containerd[1414]: time="2025-09-12T17:44:30.714873016Z" level=info msg="loading plugin \"io.containerd.nri.v1.nri\"..." type=io.containerd.nri.v1 Sep 12 17:44:30.714924 containerd[1414]: time="2025-09-12T17:44:30.714885710Z" level=info msg="NRI interface is disabled by configuration." Sep 12 17:44:30.714924 containerd[1414]: time="2025-09-12T17:44:30.714898955Z" level=info msg="loading plugin \"io.containerd.grpc.v1.cri\"..." type=io.containerd.grpc.v1 Sep 12 17:44:30.715305 containerd[1414]: time="2025-09-12T17:44:30.715230677Z" level=info msg="Start cri plugin with config {PluginConfig:{ContainerdConfig:{Snapshotter:overlayfs DefaultRuntimeName:runc DefaultRuntime:{Type: Path: Engine: PodAnnotations:[] ContainerAnnotations:[] Root: Options:map[] PrivilegedWithoutHostDevices:false PrivilegedWithoutHostDevicesAllDevicesAllowed:false BaseRuntimeSpec: NetworkPluginConfDir: NetworkPluginMaxConfNum:0 Snapshotter: SandboxMode:} UntrustedWorkloadRuntime:{Type: Path: Engine: PodAnnotations:[] ContainerAnnotations:[] Root: Options:map[] PrivilegedWithoutHostDevices:false PrivilegedWithoutHostDevicesAllDevicesAllowed:false BaseRuntimeSpec: NetworkPluginConfDir: NetworkPluginMaxConfNum:0 Snapshotter: SandboxMode:} Runtimes:map[runc:{Type:io.containerd.runc.v2 Path: Engine: PodAnnotations:[] ContainerAnnotations:[] Root: Options:map[SystemdCgroup:true] PrivilegedWithoutHostDevices:false PrivilegedWithoutHostDevicesAllDevicesAllowed:false BaseRuntimeSpec: NetworkPluginConfDir: NetworkPluginMaxConfNum:0 Snapshotter: SandboxMode:podsandbox}] NoPivot:false DisableSnapshotAnnotations:true DiscardUnpackedLayers:false IgnoreBlockIONotEnabledErrors:false IgnoreRdtNotEnabledErrors:false} CniConfig:{NetworkPluginBinDir:/opt/cni/bin NetworkPluginConfDir:/etc/cni/net.d NetworkPluginMaxConfNum:1 NetworkPluginSetupSerially:false NetworkPluginConfTemplate: IPPreference:} Registry:{ConfigPath: Mirrors:map[] Configs:map[] Auths:map[] Headers:map[]} ImageDecryption:{KeyModel:node} DisableTCPService:true StreamServerAddress:127.0.0.1 StreamServerPort:0 StreamIdleTimeout:4h0m0s EnableSelinux:true SelinuxCategoryRange:1024 SandboxImage:registry.k8s.io/pause:3.8 StatsCollectPeriod:10 SystemdCgroup:false EnableTLSStreaming:false X509KeyPairStreaming:{TLSCertFile: TLSKeyFile:} MaxContainerLogLineSize:16384 DisableCgroup:false DisableApparmor:false RestrictOOMScoreAdj:false MaxConcurrentDownloads:3 DisableProcMount:false UnsetSeccompProfile: TolerateMissingHugetlbController:true DisableHugetlbController:true DeviceOwnershipFromSecurityContext:false IgnoreImageDefinedVolumes:false NetNSMountsUnderStateDir:false EnableUnprivilegedPorts:false EnableUnprivilegedICMP:false EnableCDI:false CDISpecDirs:[/etc/cdi /var/run/cdi] ImagePullProgressTimeout:5m0s DrainExecSyncIOTimeout:0s ImagePullWithSyncFs:false IgnoreDeprecationWarnings:[]} ContainerdRootDir:/var/lib/containerd ContainerdEndpoint:/run/containerd/containerd.sock RootDir:/var/lib/containerd/io.containerd.grpc.v1.cri StateDir:/run/containerd/io.containerd.grpc.v1.cri}" Sep 12 17:44:30.715452 containerd[1414]: time="2025-09-12T17:44:30.715310527Z" level=info msg="Connect containerd service" Sep 12 17:44:30.715452 containerd[1414]: time="2025-09-12T17:44:30.715355622Z" level=info msg="using legacy CRI server" Sep 12 17:44:30.715452 containerd[1414]: time="2025-09-12T17:44:30.715365290Z" level=info msg="using experimental NRI integration - disable nri plugin to prevent this" Sep 12 17:44:30.715515 containerd[1414]: time="2025-09-12T17:44:30.715482009Z" level=info msg="Get image filesystem path \"/var/lib/containerd/io.containerd.snapshotter.v1.overlayfs\"" Sep 12 17:44:30.716307 containerd[1414]: time="2025-09-12T17:44:30.716277210Z" 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" Sep 12 17:44:30.716473 containerd[1414]: time="2025-09-12T17:44:30.716421271Z" level=info msg="Start subscribing containerd event" Sep 12 17:44:30.716499 containerd[1414]: time="2025-09-12T17:44:30.716478798Z" level=info msg="Start recovering state" Sep 12 17:44:30.716549 containerd[1414]: time="2025-09-12T17:44:30.716537458Z" level=info msg="Start event monitor" Sep 12 17:44:30.716572 containerd[1414]: time="2025-09-12T17:44:30.716549852Z" level=info msg="Start snapshots syncer" Sep 12 17:44:30.716572 containerd[1414]: time="2025-09-12T17:44:30.716559790Z" level=info msg="Start cni network conf syncer for default" Sep 12 17:44:30.716572 containerd[1414]: time="2025-09-12T17:44:30.716567204Z" level=info msg="Start streaming server" Sep 12 17:44:30.716705 containerd[1414]: time="2025-09-12T17:44:30.716680156Z" level=info msg=serving... address=/run/containerd/containerd.sock.ttrpc Sep 12 17:44:30.716768 containerd[1414]: time="2025-09-12T17:44:30.716752923Z" level=info msg=serving... address=/run/containerd/containerd.sock Sep 12 17:44:30.717235 containerd[1414]: time="2025-09-12T17:44:30.716822673Z" level=info msg="containerd successfully booted in 0.039204s" Sep 12 17:44:30.716913 systemd[1]: Started containerd.service - containerd container runtime. Sep 12 17:44:30.754244 sshd_keygen[1403]: ssh-keygen: generating new host keys: RSA ECDSA ED25519 Sep 12 17:44:30.778501 systemd[1]: Finished sshd-keygen.service - Generate sshd host keys. Sep 12 17:44:30.792133 systemd[1]: Starting issuegen.service - Generate /run/issue... Sep 12 17:44:30.799915 systemd[1]: issuegen.service: Deactivated successfully. Sep 12 17:44:30.800181 systemd[1]: Finished issuegen.service - Generate /run/issue. Sep 12 17:44:30.803027 systemd[1]: Starting systemd-user-sessions.service - Permit User Sessions... Sep 12 17:44:30.818815 systemd[1]: Finished systemd-user-sessions.service - Permit User Sessions. Sep 12 17:44:30.821756 systemd[1]: Started getty@tty1.service - Getty on tty1. Sep 12 17:44:30.823784 systemd[1]: Started serial-getty@ttyS0.service - Serial Getty on ttyS0. Sep 12 17:44:30.825039 systemd[1]: Reached target getty.target - Login Prompts. Sep 12 17:44:31.696087 systemd-networkd[1333]: eth0: Gained IPv6LL Sep 12 17:44:31.699914 systemd[1]: Finished systemd-networkd-wait-online.service - Wait for Network to be Configured. Sep 12 17:44:31.701926 systemd[1]: Reached target network-online.target - Network is Online. Sep 12 17:44:31.717155 systemd[1]: Starting coreos-metadata.service - QEMU metadata agent... Sep 12 17:44:31.719589 systemd[1]: Starting nvidia.service - NVIDIA Configure Service... Sep 12 17:44:31.739206 systemd[1]: coreos-metadata.service: Deactivated successfully. Sep 12 17:44:31.739479 systemd[1]: Finished coreos-metadata.service - QEMU metadata agent. Sep 12 17:44:31.741138 systemd[1]: packet-phone-home.service - Report Success to Packet was skipped because no trigger condition checks were met. Sep 12 17:44:31.742800 systemd[1]: Finished nvidia.service - NVIDIA Configure Service. Sep 12 17:44:31.744490 systemd[1]: Reached target multi-user.target - Multi-User System. Sep 12 17:44:31.745811 systemd[1]: Startup finished in 812ms (kernel) + 3.969s (initrd) + 3.580s (userspace) = 8.362s. Sep 12 17:44:37.514750 systemd[1]: Created slice system-sshd.slice - Slice /system/sshd. Sep 12 17:44:37.516174 systemd[1]: Started sshd@0-10.0.0.158:22-10.0.0.1:44634.service - OpenSSH per-connection server daemon (10.0.0.1:44634). Sep 12 17:44:37.562591 sshd[1482]: Accepted publickey for core from 10.0.0.1 port 44634 ssh2: RSA SHA256:/3iCKt022AmlyeTJlfGC2G4n7imjC85tKhX8vqxRig4 Sep 12 17:44:37.565059 sshd[1482]: pam_unix(sshd:session): session opened for user core(uid=500) by core(uid=0) Sep 12 17:44:37.574555 systemd[1]: Created slice user-500.slice - User Slice of UID 500. Sep 12 17:44:37.586169 systemd[1]: Starting user-runtime-dir@500.service - User Runtime Directory /run/user/500... Sep 12 17:44:37.588331 systemd-logind[1390]: New session 1 of user core. Sep 12 17:44:37.599923 systemd[1]: Finished user-runtime-dir@500.service - User Runtime Directory /run/user/500. Sep 12 17:44:37.613230 systemd[1]: Starting user@500.service - User Manager for UID 500... Sep 12 17:44:37.616484 (systemd)[1486]: pam_unix(systemd-user:session): session opened for user core(uid=500) by (uid=0) Sep 12 17:44:37.761731 systemd[1486]: Queued start job for default target default.target. Sep 12 17:44:37.774404 systemd[1486]: Created slice app.slice - User Application Slice. Sep 12 17:44:37.774435 systemd[1486]: Reached target paths.target - Paths. Sep 12 17:44:37.774450 systemd[1486]: Reached target timers.target - Timers. Sep 12 17:44:37.776357 systemd[1486]: Starting dbus.socket - D-Bus User Message Bus Socket... Sep 12 17:44:37.789393 systemd[1486]: Listening on dbus.socket - D-Bus User Message Bus Socket. Sep 12 17:44:37.789570 systemd[1486]: Reached target sockets.target - Sockets. Sep 12 17:44:37.789598 systemd[1486]: Reached target basic.target - Basic System. Sep 12 17:44:37.789649 systemd[1486]: Reached target default.target - Main User Target. Sep 12 17:44:37.789697 systemd[1486]: Startup finished in 165ms. Sep 12 17:44:37.790204 systemd[1]: Started user@500.service - User Manager for UID 500. Sep 12 17:44:37.791980 systemd[1]: Started session-1.scope - Session 1 of User core. Sep 12 17:44:37.852469 systemd[1]: Started sshd@1-10.0.0.158:22-10.0.0.1:44640.service - OpenSSH per-connection server daemon (10.0.0.1:44640). Sep 12 17:44:37.894744 sshd[1497]: Accepted publickey for core from 10.0.0.1 port 44640 ssh2: RSA SHA256:/3iCKt022AmlyeTJlfGC2G4n7imjC85tKhX8vqxRig4 Sep 12 17:44:37.896737 sshd[1497]: pam_unix(sshd:session): session opened for user core(uid=500) by core(uid=0) Sep 12 17:44:37.901660 systemd-logind[1390]: New session 2 of user core. Sep 12 17:44:37.920127 systemd[1]: Started session-2.scope - Session 2 of User core. Sep 12 17:44:37.977016 sshd[1497]: pam_unix(sshd:session): session closed for user core Sep 12 17:44:37.985439 systemd[1]: sshd@1-10.0.0.158:22-10.0.0.1:44640.service: Deactivated successfully. Sep 12 17:44:37.987623 systemd[1]: session-2.scope: Deactivated successfully. Sep 12 17:44:37.989284 systemd-logind[1390]: Session 2 logged out. Waiting for processes to exit. Sep 12 17:44:37.990896 systemd[1]: Started sshd@2-10.0.0.158:22-10.0.0.1:44654.service - OpenSSH per-connection server daemon (10.0.0.1:44654). Sep 12 17:44:37.991875 systemd-logind[1390]: Removed session 2. Sep 12 17:44:38.038942 sshd[1504]: Accepted publickey for core from 10.0.0.1 port 44654 ssh2: RSA SHA256:/3iCKt022AmlyeTJlfGC2G4n7imjC85tKhX8vqxRig4 Sep 12 17:44:38.040748 sshd[1504]: pam_unix(sshd:session): session opened for user core(uid=500) by core(uid=0) Sep 12 17:44:38.045499 systemd-logind[1390]: New session 3 of user core. Sep 12 17:44:38.057115 systemd[1]: Started session-3.scope - Session 3 of User core. Sep 12 17:44:38.110262 sshd[1504]: pam_unix(sshd:session): session closed for user core Sep 12 17:44:38.118399 systemd[1]: sshd@2-10.0.0.158:22-10.0.0.1:44654.service: Deactivated successfully. Sep 12 17:44:38.120525 systemd[1]: session-3.scope: Deactivated successfully. Sep 12 17:44:38.122489 systemd-logind[1390]: Session 3 logged out. Waiting for processes to exit. Sep 12 17:44:38.129224 systemd[1]: Started sshd@3-10.0.0.158:22-10.0.0.1:44664.service - OpenSSH per-connection server daemon (10.0.0.1:44664). Sep 12 17:44:38.130296 systemd-logind[1390]: Removed session 3. Sep 12 17:44:38.162958 sshd[1511]: Accepted publickey for core from 10.0.0.1 port 44664 ssh2: RSA SHA256:/3iCKt022AmlyeTJlfGC2G4n7imjC85tKhX8vqxRig4 Sep 12 17:44:38.165049 sshd[1511]: pam_unix(sshd:session): session opened for user core(uid=500) by core(uid=0) Sep 12 17:44:38.169467 systemd-logind[1390]: New session 4 of user core. Sep 12 17:44:38.178985 systemd[1]: Started session-4.scope - Session 4 of User core. Sep 12 17:44:38.236350 sshd[1511]: pam_unix(sshd:session): session closed for user core Sep 12 17:44:38.250247 systemd[1]: sshd@3-10.0.0.158:22-10.0.0.1:44664.service: Deactivated successfully. Sep 12 17:44:38.252260 systemd[1]: session-4.scope: Deactivated successfully. Sep 12 17:44:38.254217 systemd-logind[1390]: Session 4 logged out. Waiting for processes to exit. Sep 12 17:44:38.255575 systemd[1]: Started sshd@4-10.0.0.158:22-10.0.0.1:44674.service - OpenSSH per-connection server daemon (10.0.0.1:44674). Sep 12 17:44:38.256486 systemd-logind[1390]: Removed session 4. Sep 12 17:44:38.305944 sshd[1518]: Accepted publickey for core from 10.0.0.1 port 44674 ssh2: RSA SHA256:/3iCKt022AmlyeTJlfGC2G4n7imjC85tKhX8vqxRig4 Sep 12 17:44:38.308135 sshd[1518]: pam_unix(sshd:session): session opened for user core(uid=500) by core(uid=0) Sep 12 17:44:38.313403 systemd-logind[1390]: New session 5 of user core. Sep 12 17:44:38.323080 systemd[1]: Started session-5.scope - Session 5 of User core. Sep 12 17:44:38.385070 sudo[1521]: core : PWD=/home/core ; USER=root ; COMMAND=/usr/sbin/setenforce 1 Sep 12 17:44:38.385619 sudo[1521]: pam_unix(sudo:session): session opened for user root(uid=0) by core(uid=500) Sep 12 17:44:38.403019 sudo[1521]: pam_unix(sudo:session): session closed for user root Sep 12 17:44:38.405272 sshd[1518]: pam_unix(sshd:session): session closed for user core Sep 12 17:44:38.418074 systemd[1]: sshd@4-10.0.0.158:22-10.0.0.1:44674.service: Deactivated successfully. Sep 12 17:44:38.420112 systemd[1]: session-5.scope: Deactivated successfully. Sep 12 17:44:38.422016 systemd-logind[1390]: Session 5 logged out. Waiting for processes to exit. Sep 12 17:44:38.437095 systemd[1]: Started sshd@5-10.0.0.158:22-10.0.0.1:44676.service - OpenSSH per-connection server daemon (10.0.0.1:44676). Sep 12 17:44:38.438177 systemd-logind[1390]: Removed session 5. Sep 12 17:44:38.467741 sshd[1526]: Accepted publickey for core from 10.0.0.1 port 44676 ssh2: RSA SHA256:/3iCKt022AmlyeTJlfGC2G4n7imjC85tKhX8vqxRig4 Sep 12 17:44:38.469679 sshd[1526]: pam_unix(sshd:session): session opened for user core(uid=500) by core(uid=0) Sep 12 17:44:38.474270 systemd-logind[1390]: New session 6 of user core. Sep 12 17:44:38.495179 systemd[1]: Started session-6.scope - Session 6 of User core. Sep 12 17:44:38.552317 sudo[1530]: 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 Sep 12 17:44:38.552718 sudo[1530]: pam_unix(sudo:session): session opened for user root(uid=0) by core(uid=500) Sep 12 17:44:38.557306 sudo[1530]: pam_unix(sudo:session): session closed for user root Sep 12 17:44:38.565345 sudo[1529]: core : PWD=/home/core ; USER=root ; COMMAND=/usr/bin/systemctl restart audit-rules Sep 12 17:44:38.565764 sudo[1529]: pam_unix(sudo:session): session opened for user root(uid=0) by core(uid=500) Sep 12 17:44:38.592248 systemd[1]: Stopping audit-rules.service - Load Security Auditing Rules... Sep 12 17:44:38.593905 auditctl[1533]: No rules Sep 12 17:44:38.595523 systemd[1]: audit-rules.service: Deactivated successfully. Sep 12 17:44:38.595818 systemd[1]: Stopped audit-rules.service - Load Security Auditing Rules. Sep 12 17:44:38.597982 systemd[1]: Starting audit-rules.service - Load Security Auditing Rules... Sep 12 17:44:38.633788 augenrules[1551]: No rules Sep 12 17:44:38.635905 systemd[1]: Finished audit-rules.service - Load Security Auditing Rules. Sep 12 17:44:38.637543 sudo[1529]: pam_unix(sudo:session): session closed for user root Sep 12 17:44:38.639829 sshd[1526]: pam_unix(sshd:session): session closed for user core Sep 12 17:44:38.648087 systemd[1]: sshd@5-10.0.0.158:22-10.0.0.1:44676.service: Deactivated successfully. Sep 12 17:44:38.650201 systemd[1]: session-6.scope: Deactivated successfully. Sep 12 17:44:38.652046 systemd-logind[1390]: Session 6 logged out. Waiting for processes to exit. Sep 12 17:44:38.661139 systemd[1]: Started sshd@6-10.0.0.158:22-10.0.0.1:44678.service - OpenSSH per-connection server daemon (10.0.0.1:44678). Sep 12 17:44:38.662118 systemd-logind[1390]: Removed session 6. Sep 12 17:44:38.692330 sshd[1559]: Accepted publickey for core from 10.0.0.1 port 44678 ssh2: RSA SHA256:/3iCKt022AmlyeTJlfGC2G4n7imjC85tKhX8vqxRig4 Sep 12 17:44:38.694072 sshd[1559]: pam_unix(sshd:session): session opened for user core(uid=500) by core(uid=0) Sep 12 17:44:38.698544 systemd-logind[1390]: New session 7 of user core. Sep 12 17:44:38.708099 systemd[1]: Started session-7.scope - Session 7 of User core. Sep 12 17:44:38.774121 systemd[1]: Starting docker.service - Docker Application Container Engine... Sep 12 17:44:38.774273 (dockerd)[1563]: docker.service: Referenced but unset environment variable evaluates to an empty string: DOCKER_CGROUPS, DOCKER_OPTS, DOCKER_OPT_BIP, DOCKER_OPT_IPMASQ, DOCKER_OPT_MTU Sep 12 17:44:39.108829 dockerd[1563]: time="2025-09-12T17:44:39.108741064Z" level=info msg="Starting up" Sep 12 17:44:39.227952 dockerd[1563]: time="2025-09-12T17:44:39.227887118Z" level=info msg="Loading containers: start." Sep 12 17:44:39.341878 kernel: Initializing XFRM netlink socket Sep 12 17:44:39.434958 systemd-networkd[1333]: docker0: Link UP Sep 12 17:44:39.454689 dockerd[1563]: time="2025-09-12T17:44:39.454642175Z" level=info msg="Loading containers: done." Sep 12 17:44:39.470244 systemd[1]: var-lib-docker-overlay2-opaque\x2dbug\x2dcheck3162812630-merged.mount: Deactivated successfully. Sep 12 17:44:39.472417 dockerd[1563]: time="2025-09-12T17:44:39.472379415Z" 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 Sep 12 17:44:39.472508 dockerd[1563]: time="2025-09-12T17:44:39.472462271Z" level=info msg="Docker daemon" commit=061aa95809be396a6b5542618d8a34b02a21ff77 containerd-snapshotter=false storage-driver=overlay2 version=26.1.0 Sep 12 17:44:39.472642 dockerd[1563]: time="2025-09-12T17:44:39.472615218Z" level=info msg="Daemon has completed initialization" Sep 12 17:44:39.513262 dockerd[1563]: time="2025-09-12T17:44:39.512831883Z" level=info msg="API listen on /run/docker.sock" Sep 12 17:44:39.513332 systemd[1]: Started docker.service - Docker Application Container Engine. Sep 12 17:44:39.522488 sshd[1559]: pam_unix(sshd:session): session closed for user core Sep 12 17:44:39.529804 systemd[1]: sshd@6-10.0.0.158:22-10.0.0.1:44678.service: Deactivated successfully. Sep 12 17:44:39.531625 systemd[1]: session-7.scope: Deactivated successfully. Sep 12 17:44:39.533227 systemd-logind[1390]: Session 7 logged out. Waiting for processes to exit. Sep 12 17:44:39.545166 systemd[1]: Started sshd@7-10.0.0.158:22-10.0.0.1:44692.service - OpenSSH per-connection server daemon (10.0.0.1:44692). Sep 12 17:44:39.546189 systemd-logind[1390]: Removed session 7. Sep 12 17:44:39.573820 sshd[1705]: Accepted publickey for core from 10.0.0.1 port 44692 ssh2: RSA SHA256:/3iCKt022AmlyeTJlfGC2G4n7imjC85tKhX8vqxRig4 Sep 12 17:44:39.575508 sshd[1705]: pam_unix(sshd:session): session opened for user core(uid=500) by core(uid=0) Sep 12 17:44:39.580162 systemd-logind[1390]: New session 8 of user core. Sep 12 17:44:39.590014 systemd[1]: Started session-8.scope - Session 8 of User core. Sep 12 17:44:40.932741 systemd[1]: var-lib-docker-overlay2-1593ed1139fb10c99bee1fa59c7b1d82dab103e66fa9ad30dbc87f9af31d43c4\x2dinit-merged.mount: Deactivated successfully. Sep 12 17:44:40.971208 kernel: docker0: port 1(veth94964c9) entered blocking state Sep 12 17:44:40.971337 kernel: docker0: port 1(veth94964c9) entered disabled state Sep 12 17:44:40.971364 kernel: veth94964c9: entered allmulticast mode Sep 12 17:44:40.972337 kernel: veth94964c9: entered promiscuous mode Sep 12 17:44:40.972477 systemd-networkd[1333]: veth94964c9: Link UP Sep 12 17:44:41.228628 containerd[1414]: time="2025-09-12T17:44:41.227954021Z" level=info msg="loading plugin \"io.containerd.event.v1.publisher\"..." runtime=io.containerd.runc.v2 type=io.containerd.event.v1 Sep 12 17:44:41.228628 containerd[1414]: time="2025-09-12T17:44:41.228512118Z" level=info msg="loading plugin \"io.containerd.internal.v1.shutdown\"..." runtime=io.containerd.runc.v2 type=io.containerd.internal.v1 Sep 12 17:44:41.228628 containerd[1414]: time="2025-09-12T17:44:41.228525383Z" level=info msg="loading plugin \"io.containerd.ttrpc.v1.task\"..." runtime=io.containerd.runc.v2 type=io.containerd.ttrpc.v1 Sep 12 17:44:41.228628 containerd[1414]: time="2025-09-12T17:44:41.228594142Z" level=info msg="loading plugin \"io.containerd.ttrpc.v1.pause\"..." runtime=io.containerd.runc.v2 type=io.containerd.ttrpc.v1 Sep 12 17:44:41.248976 systemd[1]: Started docker-a6d53bc6d794ee7d149764e670b68847f04c2ab080d531a03e7c4880ae43eb83.scope - libcontainer container a6d53bc6d794ee7d149764e670b68847f04c2ab080d531a03e7c4880ae43eb83. Sep 12 17:44:41.311869 kernel: eth0: renamed from veth854b296 Sep 12 17:44:41.318867 kernel: docker0: port 1(veth94964c9) entered blocking state Sep 12 17:44:41.318911 kernel: docker0: port 1(veth94964c9) entered forwarding state Sep 12 17:44:41.318872 systemd-networkd[1333]: veth94964c9: Gained carrier Sep 12 17:44:41.319594 systemd-networkd[1333]: docker0: Gained carrier Sep 12 17:44:41.379947 systemd-resolved[1276]: Failed to determine the local hostname and LLMNR/mDNS names, ignoring: No such device or address Sep 12 17:44:41.473053 sshd[1705]: pam_unix(sshd:session): session closed for user core Sep 12 17:44:41.485572 systemd[1]: sshd@7-10.0.0.158:22-10.0.0.1:44692.service: Deactivated successfully. Sep 12 17:44:41.487211 systemd[1]: session-8.scope: Deactivated successfully. Sep 12 17:44:41.487763 systemd-logind[1390]: Session 8 logged out. Waiting for processes to exit. Sep 12 17:44:41.498170 systemd[1]: Started sshd@8-10.0.0.158:22-10.0.0.1:59708.service - OpenSSH per-connection server daemon (10.0.0.1:59708). Sep 12 17:44:41.499495 systemd-logind[1390]: Removed session 8. Sep 12 17:44:41.525876 sshd[1786]: Accepted publickey for core from 10.0.0.1 port 59708 ssh2: RSA SHA256:/3iCKt022AmlyeTJlfGC2G4n7imjC85tKhX8vqxRig4 Sep 12 17:44:41.527360 sshd[1786]: pam_unix(sshd:session): session opened for user core(uid=500) by core(uid=0) Sep 12 17:44:41.531414 systemd-logind[1390]: New session 9 of user core. Sep 12 17:44:41.539991 systemd[1]: Started session-9.scope - Session 9 of User core. Sep 12 17:44:41.597809 sshd[1786]: pam_unix(sshd:session): session closed for user core Sep 12 17:44:41.610450 systemd[1]: sshd@8-10.0.0.158:22-10.0.0.1:59708.service: Deactivated successfully. Sep 12 17:44:41.612015 systemd[1]: session-9.scope: Deactivated successfully. Sep 12 17:44:41.612700 systemd-logind[1390]: Session 9 logged out. Waiting for processes to exit. Sep 12 17:44:41.626112 systemd[1]: Started sshd@9-10.0.0.158:22-10.0.0.1:59710.service - OpenSSH per-connection server daemon (10.0.0.1:59710). Sep 12 17:44:41.626687 systemd-logind[1390]: Removed session 9. Sep 12 17:44:41.654320 sshd[1793]: Accepted publickey for core from 10.0.0.1 port 59710 ssh2: RSA SHA256:/3iCKt022AmlyeTJlfGC2G4n7imjC85tKhX8vqxRig4 Sep 12 17:44:41.655745 sshd[1793]: pam_unix(sshd:session): session opened for user core(uid=500) by core(uid=0) Sep 12 17:44:41.659705 systemd-logind[1390]: New session 10 of user core. Sep 12 17:44:41.672957 systemd[1]: Started session-10.scope - Session 10 of User core. Sep 12 17:44:41.726702 sudo[1796]: core : PWD=/home/core ; USER=root ; COMMAND=/usr/bin/kill -SIGTERM 1414 Sep 12 17:44:41.727098 sudo[1796]: pam_unix(sudo:session): session opened for user root(uid=0) by core(uid=500) Sep 12 17:44:41.730670 sudo[1796]: pam_unix(sudo:session): session closed for user root Sep 12 17:44:41.730934 containerd[1414]: time="2025-09-12T17:44:41.730715458Z" level=info msg="Stop CRI service" Sep 12 17:44:41.730981 dockerd[1563]: time="2025-09-12T17:44:41.730928057Z" level=error msg="Failed to get event" error="rpc error: code = Unavailable desc = error reading from server: EOF" module=libcontainerd namespace=plugins.moby Sep 12 17:44:41.730981 dockerd[1563]: time="2025-09-12T17:44:41.730960688Z" level=info msg="Waiting for containerd to be ready to restart event processing" module=libcontainerd namespace=plugins.moby Sep 12 17:44:41.731355 dockerd[1563]: time="2025-09-12T17:44:41.731194928Z" level=error msg="Failed to get event" error="rpc error: code = Unavailable desc = error reading from server: EOF" module=libcontainerd namespace=moby Sep 12 17:44:41.731355 dockerd[1563]: time="2025-09-12T17:44:41.731208192Z" level=info msg="Waiting for containerd to be ready to restart event processing" module=libcontainerd namespace=moby Sep 12 17:44:41.732232 sshd[1793]: pam_unix(sshd:session): session closed for user core Sep 12 17:44:41.733133 containerd[1414]: time="2025-09-12T17:44:41.733034017Z" level=info msg="Stop CRI service" Sep 12 17:44:41.733133 containerd[1414]: time="2025-09-12T17:44:41.733101804Z" level=info msg="Event monitor stopped" Sep 12 17:44:41.740105 systemd[1]: containerd.service: Deactivated successfully. Sep 12 17:44:41.740184 systemd[1]: containerd.service: Unit process 1739 (containerd-shim) remains running after unit stopped. Sep 12 17:44:41.740964 systemd[1]: sshd@9-10.0.0.158:22-10.0.0.1:59710.service: Deactivated successfully. Sep 12 17:44:41.742986 systemd[1]: session-10.scope: Deactivated successfully. Sep 12 17:44:41.744755 systemd-logind[1390]: Session 10 logged out. Waiting for processes to exit. Sep 12 17:44:41.761900 systemd[1]: Started sshd@10-10.0.0.158:22-10.0.0.1:59726.service - OpenSSH per-connection server daemon (10.0.0.1:59726). Sep 12 17:44:41.762589 systemd-logind[1390]: Removed session 10. Sep 12 17:44:41.790305 sshd[1802]: Accepted publickey for core from 10.0.0.1 port 59726 ssh2: RSA SHA256:/3iCKt022AmlyeTJlfGC2G4n7imjC85tKhX8vqxRig4 Sep 12 17:44:41.792043 sshd[1802]: pam_unix(sshd:session): session opened for user core(uid=500) by core(uid=0) Sep 12 17:44:41.796341 systemd-logind[1390]: New session 11 of user core. Sep 12 17:44:41.805984 systemd[1]: Started session-11.scope - Session 11 of User core. Sep 12 17:44:41.863933 sshd[1802]: pam_unix(sshd:session): session closed for user core Sep 12 17:44:41.868976 systemd[1]: sshd@10-10.0.0.158:22-10.0.0.1:59726.service: Deactivated successfully. Sep 12 17:44:41.871299 systemd[1]: session-11.scope: Deactivated successfully. Sep 12 17:44:41.872068 systemd-logind[1390]: Session 11 logged out. Waiting for processes to exit. Sep 12 17:44:41.873072 systemd-logind[1390]: Removed session 11. Sep 12 17:44:42.576003 systemd-networkd[1333]: veth94964c9: Gained IPv6LL Sep 12 17:44:42.639921 systemd-networkd[1333]: docker0: Gained IPv6LL Sep 12 17:44:46.990582 systemd[1]: containerd.service: Scheduled restart job, restart counter is at 1. Sep 12 17:44:46.991097 systemd[1]: Stopping docker.service - Docker Application Container Engine... Sep 12 17:44:46.991208 dockerd[1563]: time="2025-09-12T17:44:46.991144039Z" level=info msg="Processing signal 'terminated'" Sep 12 17:44:47.877758 systemd[1]: Started sshd@11-10.0.0.158:22-10.0.0.1:59736.service - OpenSSH per-connection server daemon (10.0.0.1:59736). Sep 12 17:44:47.910305 sshd[1809]: Accepted publickey for core from 10.0.0.1 port 59736 ssh2: RSA SHA256:/3iCKt022AmlyeTJlfGC2G4n7imjC85tKhX8vqxRig4 Sep 12 17:44:47.911694 sshd[1809]: pam_unix(sshd:session): session opened for user core(uid=500) by core(uid=0) Sep 12 17:44:47.915610 systemd-logind[1390]: New session 12 of user core. Sep 12 17:44:47.926980 systemd[1]: Started session-12.scope - Session 12 of User core. Sep 12 17:44:47.984470 sshd[1809]: pam_unix(sshd:session): session closed for user core Sep 12 17:44:47.988745 systemd[1]: sshd@11-10.0.0.158:22-10.0.0.1:59736.service: Deactivated successfully. Sep 12 17:44:47.990643 systemd[1]: session-12.scope: Deactivated successfully. Sep 12 17:44:47.991291 systemd-logind[1390]: Session 12 logged out. Waiting for processes to exit. Sep 12 17:44:47.992225 systemd-logind[1390]: Removed session 12. Sep 12 17:44:48.992224 dockerd[1563]: time="2025-09-12T17:44:48.992131519Z" level=error msg="Error sending stop (signal 15) to container" container=a6d53bc6d794ee7d149764e670b68847f04c2ab080d531a03e7c4880ae43eb83 error="Cannot kill container a6d53bc6d794ee7d149764e670b68847f04c2ab080d531a03e7c4880ae43eb83: connection error: desc = \"transport: Error while dialing: dial unix:///var/run/docker/libcontainerd/docker-containerd.sock: timeout\": unavailable" Sep 12 17:44:48.992224 dockerd[1563]: time="2025-09-12T17:44:48.992208674Z" level=info msg="Container failed to exit within 2s of signal 15 - using the force" container=a6d53bc6d794ee7d149764e670b68847f04c2ab080d531a03e7c4880ae43eb83 Sep 12 17:44:53.997218 systemd[1]: Started sshd@12-10.0.0.158:22-10.0.0.1:36852.service - OpenSSH per-connection server daemon (10.0.0.1:36852). Sep 12 17:44:54.029688 sshd[1816]: Accepted publickey for core from 10.0.0.1 port 36852 ssh2: RSA SHA256:/3iCKt022AmlyeTJlfGC2G4n7imjC85tKhX8vqxRig4 Sep 12 17:44:54.031493 sshd[1816]: pam_unix(sshd:session): session opened for user core(uid=500) by core(uid=0) Sep 12 17:44:54.035993 systemd-logind[1390]: New session 13 of user core. Sep 12 17:44:54.049033 systemd[1]: Started session-13.scope - Session 13 of User core. Sep 12 17:44:54.105077 sshd[1816]: pam_unix(sshd:session): session closed for user core Sep 12 17:44:54.109020 systemd[1]: sshd@12-10.0.0.158:22-10.0.0.1:36852.service: Deactivated successfully. Sep 12 17:44:54.111286 systemd[1]: session-13.scope: Deactivated successfully. Sep 12 17:44:54.111938 systemd-logind[1390]: Session 13 logged out. Waiting for processes to exit. Sep 12 17:44:54.112856 systemd-logind[1390]: Removed session 13. Sep 12 17:44:58.992606 dockerd[1563]: time="2025-09-12T17:44:58.992507556Z" level=warning msg="Container failed to exit within 10s of kill - trying direct SIGKILL" container=a6d53bc6d794ee7d149764e670b68847f04c2ab080d531a03e7c4880ae43eb83 error="context deadline exceeded" Sep 12 17:44:58.994045 systemd[1]: docker-a6d53bc6d794ee7d149764e670b68847f04c2ab080d531a03e7c4880ae43eb83.scope: Deactivated successfully. Sep 12 17:45:00.116032 systemd[1]: Started sshd@13-10.0.0.158:22-10.0.0.1:48030.service - OpenSSH per-connection server daemon (10.0.0.1:48030). Sep 12 17:45:00.148213 sshd[1823]: Accepted publickey for core from 10.0.0.1 port 48030 ssh2: RSA SHA256:/3iCKt022AmlyeTJlfGC2G4n7imjC85tKhX8vqxRig4 Sep 12 17:45:00.149948 sshd[1823]: pam_unix(sshd:session): session opened for user core(uid=500) by core(uid=0) Sep 12 17:45:00.154743 systemd-logind[1390]: New session 14 of user core. Sep 12 17:45:00.163133 systemd[1]: Started session-14.scope - Session 14 of User core. Sep 12 17:45:00.223014 sshd[1823]: pam_unix(sshd:session): session closed for user core Sep 12 17:45:00.230710 systemd[1]: sshd@13-10.0.0.158:22-10.0.0.1:48030.service: Deactivated successfully. Sep 12 17:45:00.233170 systemd[1]: session-14.scope: Deactivated successfully. Sep 12 17:45:00.233867 systemd-logind[1390]: Session 14 logged out. Waiting for processes to exit. Sep 12 17:45:00.234885 systemd-logind[1390]: Removed session 14. Sep 12 17:45:01.992731 dockerd[1563]: time="2025-09-12T17:45:01.992641640Z" level=error msg="Force shutdown daemon" Sep 12 17:45:01.993257 dockerd[1563]: time="2025-09-12T17:45:01.992932235Z" level=info msg="Daemon shutdown complete" Sep 12 17:45:02.010061 systemd[1]: docker.service: Deactivated successfully. Sep 12 17:45:02.010521 systemd[1]: Stopped docker.service - Docker Application Container Engine. Sep 12 17:45:02.010620 systemd[1]: docker.service: Consumed 1.233s CPU time. Sep 12 17:45:02.011227 systemd[1]: docker.socket: Deactivated successfully. Sep 12 17:45:02.012774 systemd[1]: Closed docker.socket - Docker Socket for the API. Sep 12 17:45:02.012824 systemd[1]: Stopping docker.socket - Docker Socket for the API... Sep 12 17:45:02.016269 systemd[1]: Starting docker.socket - Docker Socket for the API... Sep 12 17:45:02.016488 systemd[1]: containerd.service: Found left-over process 1739 (containerd-shim) in control group while starting unit. Ignoring. Sep 12 17:45:02.016510 systemd[1]: containerd.service: This usually indicates unclean termination of a previous run, or service implementation deficiencies. Sep 12 17:45:02.026526 systemd[1]: Starting containerd.service - containerd container runtime... Sep 12 17:45:02.027674 systemd[1]: Listening on docker.socket - Docker Socket for the API. Sep 12 17:45:02.039365 systemd[1]: containerd.service: Found left-over process 1739 (containerd-shim) in control group while starting unit. Ignoring. Sep 12 17:45:02.039377 systemd[1]: containerd.service: This usually indicates unclean termination of a previous run, or service implementation deficiencies. Sep 12 17:45:02.047163 (ntainerd)[1835]: containerd.service: Referenced but unset environment variable evaluates to an empty string: TORCX_IMAGEDIR, TORCX_UNPACKDIR Sep 12 17:45:02.078752 containerd[1835]: time="2025-09-12T17:45:02.078618368Z" level=info msg="starting containerd" revision=174e0d1785eeda18dc2beba45e1d5a188771636b version=v1.7.21 Sep 12 17:45:02.111583 containerd[1835]: time="2025-09-12T17:45:02.111485998Z" level=info msg="loading plugin \"io.containerd.snapshotter.v1.aufs\"..." type=io.containerd.snapshotter.v1 Sep 12 17:45:02.113950 containerd[1835]: time="2025-09-12T17:45:02.113867696Z" level=info msg="skip loading plugin \"io.containerd.snapshotter.v1.aufs\"..." error="aufs is not supported (modprobe aufs failed: exit status 1 \"modprobe: FATAL: Module aufs not found in directory /lib/modules/6.6.106-flatcar\\n\"): skip plugin" type=io.containerd.snapshotter.v1 Sep 12 17:45:02.113950 containerd[1835]: time="2025-09-12T17:45:02.113931896Z" level=info msg="loading plugin \"io.containerd.event.v1.exchange\"..." type=io.containerd.event.v1 Sep 12 17:45:02.114059 containerd[1835]: time="2025-09-12T17:45:02.113956913Z" level=info msg="loading plugin \"io.containerd.internal.v1.opt\"..." type=io.containerd.internal.v1 Sep 12 17:45:02.114059 containerd[1835]: time="2025-09-12T17:45:02.114014371Z" level=info msg="loading plugin \"io.containerd.warning.v1.deprecations\"..." type=io.containerd.warning.v1 Sep 12 17:45:02.114059 containerd[1835]: time="2025-09-12T17:45:02.114031122Z" level=info msg="loading plugin \"io.containerd.snapshotter.v1.blockfile\"..." type=io.containerd.snapshotter.v1 Sep 12 17:45:02.114151 containerd[1835]: time="2025-09-12T17:45:02.114061048Z" level=info msg="skip loading plugin \"io.containerd.snapshotter.v1.blockfile\"..." error="no scratch file generator: skip plugin" type=io.containerd.snapshotter.v1 Sep 12 17:45:02.114151 containerd[1835]: time="2025-09-12T17:45:02.114076016Z" level=info msg="loading plugin \"io.containerd.snapshotter.v1.btrfs\"..." type=io.containerd.snapshotter.v1 Sep 12 17:45:02.114369 containerd[1835]: time="2025-09-12T17:45:02.114329021Z" 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 Sep 12 17:45:02.114369 containerd[1835]: time="2025-09-12T17:45:02.114355360Z" level=info msg="loading plugin \"io.containerd.snapshotter.v1.devmapper\"..." type=io.containerd.snapshotter.v1 Sep 12 17:45:02.114447 containerd[1835]: time="2025-09-12T17:45:02.114373855Z" level=info msg="skip loading plugin \"io.containerd.snapshotter.v1.devmapper\"..." error="devmapper not configured: skip plugin" type=io.containerd.snapshotter.v1 Sep 12 17:45:02.114447 containerd[1835]: time="2025-09-12T17:45:02.114388693Z" level=info msg="loading plugin \"io.containerd.snapshotter.v1.native\"..." type=io.containerd.snapshotter.v1 Sep 12 17:45:02.114447 containerd[1835]: time="2025-09-12T17:45:02.114419080Z" level=info msg="loading plugin \"io.containerd.snapshotter.v1.overlayfs\"..." type=io.containerd.snapshotter.v1 Sep 12 17:45:02.114633 containerd[1835]: time="2025-09-12T17:45:02.114595781Z" level=info msg="loading plugin \"io.containerd.snapshotter.v1.zfs\"..." type=io.containerd.snapshotter.v1 Sep 12 17:45:02.114829 containerd[1835]: time="2025-09-12T17:45:02.114787140Z" 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 Sep 12 17:45:02.114829 containerd[1835]: time="2025-09-12T17:45:02.114815834Z" level=info msg="loading plugin \"io.containerd.content.v1.content\"..." type=io.containerd.content.v1 Sep 12 17:45:02.114924 containerd[1835]: time="2025-09-12T17:45:02.114867481Z" level=info msg="loading plugin \"io.containerd.metadata.v1.bolt\"..." type=io.containerd.metadata.v1 Sep 12 17:45:02.114924 containerd[1835]: time="2025-09-12T17:45:02.114893319Z" level=info msg="metadata content store policy set" policy=shared Sep 12 17:45:02.115114 containerd[1835]: time="2025-09-12T17:45:02.115073778Z" level=info msg="loading plugin \"io.containerd.gc.v1.scheduler\"..." type=io.containerd.gc.v1 Sep 12 17:45:02.115162 containerd[1835]: time="2025-09-12T17:45:02.115117820Z" level=info msg="loading plugin \"io.containerd.differ.v1.walking\"..." type=io.containerd.differ.v1 Sep 12 17:45:02.115162 containerd[1835]: time="2025-09-12T17:45:02.115137317Z" level=info msg="loading plugin \"io.containerd.lease.v1.manager\"..." type=io.containerd.lease.v1 Sep 12 17:45:02.115281 containerd[1835]: time="2025-09-12T17:45:02.115160831Z" level=info msg="loading plugin \"io.containerd.streaming.v1.manager\"..." type=io.containerd.streaming.v1 Sep 12 17:45:02.115281 containerd[1835]: time="2025-09-12T17:45:02.115185057Z" level=info msg="loading plugin \"io.containerd.runtime.v1.linux\"..." type=io.containerd.runtime.v1 Sep 12 17:45:02.115281 containerd[1835]: time="2025-09-12T17:45:02.115254397Z" level=info msg="loading plugin \"io.containerd.monitor.v1.cgroups\"..." type=io.containerd.monitor.v1 Sep 12 17:45:02.115570 containerd[1835]: time="2025-09-12T17:45:02.115530074Z" level=info msg="loading plugin \"io.containerd.runtime.v2.task\"..." type=io.containerd.runtime.v2 Sep 12 17:45:02.124984 containerd[1835]: time="2025-09-12T17:45:02.124905800Z" level=info msg="cleaning leaked shim process" id=a6d53bc6d794ee7d149764e670b68847f04c2ab080d531a03e7c4880ae43eb83 namespace=moby Sep 12 17:45:02.148079 containerd[1835]: time="2025-09-12T17:45:02.147992083Z" level=error msg="post event" error="failed to connect: dial unix /run/containerd/containerd.sock.ttrpc: connect: connection refused" Sep 12 17:45:02.149506 containerd[1835]: time="2025-09-12T17:45:02.149227621Z" level=info msg="shim disconnected" id=a6d53bc6d794ee7d149764e670b68847f04c2ab080d531a03e7c4880ae43eb83 namespace=moby Sep 12 17:45:02.149506 containerd[1835]: time="2025-09-12T17:45:02.149325554Z" level=warning msg="cleaning up after shim disconnected" id=a6d53bc6d794ee7d149764e670b68847f04c2ab080d531a03e7c4880ae43eb83 namespace=moby Sep 12 17:45:02.149506 containerd[1835]: time="2025-09-12T17:45:02.149338499Z" level=info msg="cleaning up dead shim" namespace=moby Sep 12 17:45:02.185158 containerd[1835]: time="2025-09-12T17:45:02.185080230Z" level=info msg="loading plugin \"io.containerd.runtime.v2.shim\"..." type=io.containerd.runtime.v2 Sep 12 17:45:02.185158 containerd[1835]: time="2025-09-12T17:45:02.185141244Z" level=info msg="loading plugin \"io.containerd.sandbox.store.v1.local\"..." type=io.containerd.sandbox.store.v1 Sep 12 17:45:02.185158 containerd[1835]: time="2025-09-12T17:45:02.185164618Z" level=info msg="loading plugin \"io.containerd.sandbox.controller.v1.local\"..." type=io.containerd.sandbox.controller.v1 Sep 12 17:45:02.185398 containerd[1835]: time="2025-09-12T17:45:02.185186499Z" level=info msg="loading plugin \"io.containerd.service.v1.containers-service\"..." type=io.containerd.service.v1 Sep 12 17:45:02.185398 containerd[1835]: time="2025-09-12T17:45:02.185207679Z" level=info msg="loading plugin \"io.containerd.service.v1.content-service\"..." type=io.containerd.service.v1 Sep 12 17:45:02.185398 containerd[1835]: time="2025-09-12T17:45:02.185226975Z" level=info msg="loading plugin \"io.containerd.service.v1.diff-service\"..." type=io.containerd.service.v1 Sep 12 17:45:02.185398 containerd[1835]: time="2025-09-12T17:45:02.185247203Z" level=info msg="loading plugin \"io.containerd.service.v1.images-service\"..." type=io.containerd.service.v1 Sep 12 17:45:02.185398 containerd[1835]: time="2025-09-12T17:45:02.185275156Z" level=info msg="loading plugin \"io.containerd.service.v1.introspection-service\"..." type=io.containerd.service.v1 Sep 12 17:45:02.185398 containerd[1835]: time="2025-09-12T17:45:02.185294933Z" level=info msg="loading plugin \"io.containerd.service.v1.namespaces-service\"..." type=io.containerd.service.v1 Sep 12 17:45:02.185398 containerd[1835]: time="2025-09-12T17:45:02.185312916Z" level=info msg="loading plugin \"io.containerd.service.v1.snapshots-service\"..." type=io.containerd.service.v1 Sep 12 17:45:02.185398 containerd[1835]: time="2025-09-12T17:45:02.185330630Z" level=info msg="loading plugin \"io.containerd.service.v1.tasks-service\"..." type=io.containerd.service.v1 Sep 12 17:45:02.185398 containerd[1835]: time="2025-09-12T17:45:02.185360836Z" level=info msg="loading plugin \"io.containerd.grpc.v1.containers\"..." type=io.containerd.grpc.v1 Sep 12 17:45:02.185398 containerd[1835]: time="2025-09-12T17:45:02.185382587Z" level=info msg="loading plugin \"io.containerd.grpc.v1.content\"..." type=io.containerd.grpc.v1 Sep 12 17:45:02.185398 containerd[1835]: time="2025-09-12T17:45:02.185401513Z" level=info msg="loading plugin \"io.containerd.grpc.v1.diff\"..." type=io.containerd.grpc.v1 Sep 12 17:45:02.185714 containerd[1835]: time="2025-09-12T17:45:02.185421500Z" level=info msg="loading plugin \"io.containerd.grpc.v1.events\"..." type=io.containerd.grpc.v1 Sep 12 17:45:02.185714 containerd[1835]: time="2025-09-12T17:45:02.185440947Z" level=info msg="loading plugin \"io.containerd.grpc.v1.images\"..." type=io.containerd.grpc.v1 Sep 12 17:45:02.185714 containerd[1835]: time="2025-09-12T17:45:02.185460573Z" level=info msg="loading plugin \"io.containerd.grpc.v1.introspection\"..." type=io.containerd.grpc.v1 Sep 12 17:45:02.185714 containerd[1835]: time="2025-09-12T17:45:02.185487153Z" level=info msg="loading plugin \"io.containerd.grpc.v1.leases\"..." type=io.containerd.grpc.v1 Sep 12 17:45:02.185714 containerd[1835]: time="2025-09-12T17:45:02.185519764Z" level=info msg="loading plugin \"io.containerd.grpc.v1.namespaces\"..." type=io.containerd.grpc.v1 Sep 12 17:45:02.185714 containerd[1835]: time="2025-09-12T17:45:02.185539131Z" level=info msg="loading plugin \"io.containerd.grpc.v1.sandbox-controllers\"..." type=io.containerd.grpc.v1 Sep 12 17:45:02.185714 containerd[1835]: time="2025-09-12T17:45:02.185561743Z" level=info msg="loading plugin \"io.containerd.grpc.v1.sandboxes\"..." type=io.containerd.grpc.v1 Sep 12 17:45:02.185714 containerd[1835]: time="2025-09-12T17:45:02.185577954Z" level=info msg="loading plugin \"io.containerd.grpc.v1.snapshots\"..." type=io.containerd.grpc.v1 Sep 12 17:45:02.185714 containerd[1835]: time="2025-09-12T17:45:02.185594755Z" level=info msg="loading plugin \"io.containerd.grpc.v1.streaming\"..." type=io.containerd.grpc.v1 Sep 12 17:45:02.185714 containerd[1835]: time="2025-09-12T17:45:02.185628969Z" level=info msg="loading plugin \"io.containerd.grpc.v1.tasks\"..." type=io.containerd.grpc.v1 Sep 12 17:45:02.185714 containerd[1835]: time="2025-09-12T17:45:02.185652784Z" level=info msg="loading plugin \"io.containerd.transfer.v1.local\"..." type=io.containerd.transfer.v1 Sep 12 17:45:02.185714 containerd[1835]: time="2025-09-12T17:45:02.185692017Z" level=info msg="loading plugin \"io.containerd.grpc.v1.transfer\"..." type=io.containerd.grpc.v1 Sep 12 17:45:02.185714 containerd[1835]: time="2025-09-12T17:45:02.185711324Z" level=info msg="loading plugin \"io.containerd.grpc.v1.version\"..." type=io.containerd.grpc.v1 Sep 12 17:45:02.186143 containerd[1835]: time="2025-09-12T17:45:02.185728296Z" level=info msg="loading plugin \"io.containerd.internal.v1.restart\"..." type=io.containerd.internal.v1 Sep 12 17:45:02.186143 containerd[1835]: time="2025-09-12T17:45:02.185789761Z" level=info msg="loading plugin \"io.containerd.tracing.processor.v1.otlp\"..." type=io.containerd.tracing.processor.v1 Sep 12 17:45:02.186143 containerd[1835]: time="2025-09-12T17:45:02.185816080Z" level=info msg="skip loading plugin \"io.containerd.tracing.processor.v1.otlp\"..." error="skip plugin: tracing endpoint not configured" type=io.containerd.tracing.processor.v1 Sep 12 17:45:02.186143 containerd[1835]: time="2025-09-12T17:45:02.185833894Z" level=info msg="loading plugin \"io.containerd.internal.v1.tracing\"..." type=io.containerd.internal.v1 Sep 12 17:45:02.186143 containerd[1835]: time="2025-09-12T17:45:02.185897773Z" level=info msg="skip loading plugin \"io.containerd.internal.v1.tracing\"..." error="skip plugin: tracing endpoint not configured" type=io.containerd.internal.v1 Sep 12 17:45:02.186143 containerd[1835]: time="2025-09-12T17:45:02.185920526Z" level=info msg="loading plugin \"io.containerd.grpc.v1.healthcheck\"..." type=io.containerd.grpc.v1 Sep 12 17:45:02.186143 containerd[1835]: time="2025-09-12T17:45:02.185945323Z" level=info msg="loading plugin \"io.containerd.nri.v1.nri\"..." type=io.containerd.nri.v1 Sep 12 17:45:02.186143 containerd[1835]: time="2025-09-12T17:45:02.185960782Z" level=info msg="NRI interface is disabled by configuration." Sep 12 17:45:02.186143 containerd[1835]: time="2025-09-12T17:45:02.185988033Z" level=info msg="loading plugin \"io.containerd.grpc.v1.cri\"..." type=io.containerd.grpc.v1 Sep 12 17:45:02.186391 containerd[1835]: time="2025-09-12T17:45:02.186316759Z" level=info msg="Start cri plugin with config {PluginConfig:{ContainerdConfig:{Snapshotter:overlayfs DefaultRuntimeName:runc DefaultRuntime:{Type: Path: Engine: PodAnnotations:[] ContainerAnnotations:[] Root: Options:map[] PrivilegedWithoutHostDevices:false PrivilegedWithoutHostDevicesAllDevicesAllowed:false BaseRuntimeSpec: NetworkPluginConfDir: NetworkPluginMaxConfNum:0 Snapshotter: SandboxMode:} UntrustedWorkloadRuntime:{Type: Path: Engine: PodAnnotations:[] ContainerAnnotations:[] Root: Options:map[] PrivilegedWithoutHostDevices:false PrivilegedWithoutHostDevicesAllDevicesAllowed:false BaseRuntimeSpec: NetworkPluginConfDir: NetworkPluginMaxConfNum:0 Snapshotter: SandboxMode:} Runtimes:map[runc:{Type:io.containerd.runc.v2 Path: Engine: PodAnnotations:[] ContainerAnnotations:[] Root: Options:map[SystemdCgroup:true] PrivilegedWithoutHostDevices:false PrivilegedWithoutHostDevicesAllDevicesAllowed:false BaseRuntimeSpec: NetworkPluginConfDir: NetworkPluginMaxConfNum:0 Snapshotter: SandboxMode:podsandbox}] NoPivot:false DisableSnapshotAnnotations:true DiscardUnpackedLayers:false IgnoreBlockIONotEnabledErrors:false IgnoreRdtNotEnabledErrors:false} CniConfig:{NetworkPluginBinDir:/opt/cni/bin NetworkPluginConfDir:/etc/cni/net.d NetworkPluginMaxConfNum:1 NetworkPluginSetupSerially:false NetworkPluginConfTemplate: IPPreference:} Registry:{ConfigPath: Mirrors:map[] Configs:map[] Auths:map[] Headers:map[]} ImageDecryption:{KeyModel:node} DisableTCPService:true StreamServerAddress:127.0.0.1 StreamServerPort:0 StreamIdleTimeout:4h0m0s EnableSelinux:true SelinuxCategoryRange:1024 SandboxImage:registry.k8s.io/pause:3.8 StatsCollectPeriod:10 SystemdCgroup:false EnableTLSStreaming:false X509KeyPairStreaming:{TLSCertFile: TLSKeyFile:} MaxContainerLogLineSize:16384 DisableCgroup:false DisableApparmor:false RestrictOOMScoreAdj:false MaxConcurrentDownloads:3 DisableProcMount:false UnsetSeccompProfile: TolerateMissingHugetlbController:true DisableHugetlbController:true DeviceOwnershipFromSecurityContext:false IgnoreImageDefinedVolumes:false NetNSMountsUnderStateDir:false EnableUnprivilegedPorts:false EnableUnprivilegedICMP:false EnableCDI:false CDISpecDirs:[/etc/cdi /var/run/cdi] ImagePullProgressTimeout:5m0s DrainExecSyncIOTimeout:0s ImagePullWithSyncFs:false IgnoreDeprecationWarnings:[]} ContainerdRootDir:/var/lib/containerd ContainerdEndpoint:/run/containerd/containerd.sock RootDir:/var/lib/containerd/io.containerd.grpc.v1.cri StateDir:/run/containerd/io.containerd.grpc.v1.cri}" Sep 12 17:45:02.186566 containerd[1835]: time="2025-09-12T17:45:02.186402380Z" level=info msg="Connect containerd service" Sep 12 17:45:02.186566 containerd[1835]: time="2025-09-12T17:45:02.186447134Z" level=info msg="using legacy CRI server" Sep 12 17:45:02.186566 containerd[1835]: time="2025-09-12T17:45:02.186457333Z" level=info msg="using experimental NRI integration - disable nri plugin to prevent this" Sep 12 17:45:02.186655 containerd[1835]: time="2025-09-12T17:45:02.186573451Z" level=info msg="Get image filesystem path \"/var/lib/containerd/io.containerd.snapshotter.v1.overlayfs\"" Sep 12 17:45:02.187188 containerd[1835]: time="2025-09-12T17:45:02.187144141Z" 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" Sep 12 17:45:02.187791 containerd[1835]: time="2025-09-12T17:45:02.187483698Z" level=info msg=serving... address=/run/containerd/containerd.sock.ttrpc Sep 12 17:45:02.190466 containerd[1835]: time="2025-09-12T17:45:02.187702479Z" level=info msg="Start subscribing containerd event" Sep 12 17:45:02.190466 containerd[1835]: time="2025-09-12T17:45:02.188068715Z" level=info msg="Start recovering state" Sep 12 17:45:02.190466 containerd[1835]: time="2025-09-12T17:45:02.188135431Z" level=info msg="Start event monitor" Sep 12 17:45:02.190466 containerd[1835]: time="2025-09-12T17:45:02.188155027Z" level=info msg="Start snapshots syncer" Sep 12 17:45:02.190466 containerd[1835]: time="2025-09-12T17:45:02.188167310Z" level=info msg="Start cni network conf syncer for default" Sep 12 17:45:02.190466 containerd[1835]: time="2025-09-12T17:45:02.188194031Z" level=info msg="Start streaming server" Sep 12 17:45:02.190466 containerd[1835]: time="2025-09-12T17:45:02.188527406Z" level=info msg=serving... address=/run/containerd/containerd.sock Sep 12 17:45:02.195647 systemd[1]: Started containerd.service - containerd container runtime. Sep 12 17:45:02.200530 containerd[1835]: time="2025-09-12T17:45:02.196894751Z" level=info msg="containerd successfully booted in 0.120216s" Sep 12 17:45:02.209469 systemd[1]: Starting docker.service - Docker Application Container Engine... Sep 12 17:45:02.209558 (dockerd)[1871]: docker.service: Referenced but unset environment variable evaluates to an empty string: DOCKER_CGROUPS, DOCKER_OPTS, DOCKER_OPT_BIP, DOCKER_OPT_IPMASQ, DOCKER_OPT_MTU Sep 12 17:45:02.290058 dockerd[1871]: time="2025-09-12T17:45:02.289828588Z" level=info msg="Starting up" Sep 12 17:45:02.344051 dockerd[1871]: time="2025-09-12T17:45:02.343984168Z" level=info msg="[graphdriver] using prior storage driver: overlay2" Sep 12 17:45:02.381295 dockerd[1871]: time="2025-09-12T17:45:02.380912355Z" level=info msg="Loading containers: start." Sep 12 17:45:02.409631 systemd[1]: var-lib-docker-overlay2-1593ed1139fb10c99bee1fa59c7b1d82dab103e66fa9ad30dbc87f9af31d43c4-merged.mount: Deactivated successfully. Sep 12 17:45:02.640725 dockerd[1871]: time="2025-09-12T17:45:02.638068977Z" level=info msg="Removing stale sandbox f40758f64eb0021408526c343926e981dbb98af18cd5f02118f2a63b9e83aab6 (a6d53bc6d794ee7d149764e670b68847f04c2ab080d531a03e7c4880ae43eb83)" Sep 12 17:45:02.645734 dockerd[1871]: time="2025-09-12T17:45:02.645667660Z" level=warning msg="Error (Unable to complete atomic operation, key modified) deleting object [endpoint 5e468048aaebaf3b873246f451e3e8d1bfc76c78c9242e82db4e972eb2905430 db01292dcddf243bca01965cb5be97df008994b74b29eb1e252ec2b44c58378e], retrying...." Sep 12 17:45:02.647833 systemd-networkd[1333]: veth94964c9: Link DOWN Sep 12 17:45:02.649224 kernel: docker0: port 1(veth94964c9) entered disabled state Sep 12 17:45:02.647864 systemd-networkd[1333]: veth94964c9: Lost carrier Sep 12 17:45:02.652626 kernel: veth94964c9 (unregistering): left allmulticast mode Sep 12 17:45:02.652696 kernel: veth94964c9 (unregistering): left promiscuous mode Sep 12 17:45:02.652723 kernel: docker0: port 1(veth94964c9) entered disabled state Sep 12 17:45:02.662143 systemd-networkd[1333]: docker0: Lost carrier Sep 12 17:45:02.771160 dockerd[1871]: time="2025-09-12T17:45:02.771076942Z" 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" Sep 12 17:45:02.850469 dockerd[1871]: time="2025-09-12T17:45:02.850403807Z" level=info msg="Loading containers: done." Sep 12 17:45:02.867147 dockerd[1871]: time="2025-09-12T17:45:02.867064638Z" 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 Sep 12 17:45:02.867440 dockerd[1871]: time="2025-09-12T17:45:02.867233515Z" level=info msg="Docker daemon" commit=061aa95809be396a6b5542618d8a34b02a21ff77 containerd-snapshotter=false storage-driver=overlay2 version=26.1.0 Sep 12 17:45:02.867440 dockerd[1871]: time="2025-09-12T17:45:02.867353039Z" level=info msg="Daemon has completed initialization" Sep 12 17:45:02.902988 dockerd[1871]: time="2025-09-12T17:45:02.902770872Z" level=info msg="API listen on /run/docker.sock" Sep 12 17:45:02.903069 systemd[1]: Started docker.service - Docker Application Container Engine. Sep 12 17:45:03.323179 systemd[1]: run-docker-netns-f40758f64eb0.mount: Deactivated successfully. Sep 12 17:45:06.236962 systemd[1]: Started sshd@14-10.0.0.158:22-10.0.0.1:48046.service - OpenSSH per-connection server daemon (10.0.0.1:48046). Sep 12 17:45:06.271812 sshd[2023]: Accepted publickey for core from 10.0.0.1 port 48046 ssh2: RSA SHA256:/3iCKt022AmlyeTJlfGC2G4n7imjC85tKhX8vqxRig4 Sep 12 17:45:06.273773 sshd[2023]: pam_unix(sshd:session): session opened for user core(uid=500) by core(uid=0) Sep 12 17:45:06.278029 systemd-logind[1390]: New session 15 of user core. Sep 12 17:45:06.287963 systemd[1]: Started session-15.scope - Session 15 of User core. Sep 12 17:45:06.346267 sshd[2023]: pam_unix(sshd:session): session closed for user core Sep 12 17:45:06.365088 systemd[1]: sshd@14-10.0.0.158:22-10.0.0.1:48046.service: Deactivated successfully. Sep 12 17:45:06.367150 systemd[1]: session-15.scope: Deactivated successfully. Sep 12 17:45:06.368915 systemd-logind[1390]: Session 15 logged out. Waiting for processes to exit. Sep 12 17:45:06.375097 systemd[1]: Started sshd@15-10.0.0.158:22-10.0.0.1:48048.service - OpenSSH per-connection server daemon (10.0.0.1:48048). Sep 12 17:45:06.375927 systemd-logind[1390]: Removed session 15. Sep 12 17:45:06.405342 sshd[2030]: Accepted publickey for core from 10.0.0.1 port 48048 ssh2: RSA SHA256:/3iCKt022AmlyeTJlfGC2G4n7imjC85tKhX8vqxRig4 Sep 12 17:45:06.407093 sshd[2030]: pam_unix(sshd:session): session opened for user core(uid=500) by core(uid=0) Sep 12 17:45:06.411292 systemd-logind[1390]: New session 16 of user core. Sep 12 17:45:06.424982 systemd[1]: Started session-16.scope - Session 16 of User core. Sep 12 17:45:06.483966 sshd[2030]: pam_unix(sshd:session): session closed for user core Sep 12 17:45:06.492423 systemd[1]: sshd@15-10.0.0.158:22-10.0.0.1:48048.service: Deactivated successfully. Sep 12 17:45:06.494699 systemd[1]: session-16.scope: Deactivated successfully. Sep 12 17:45:06.496692 systemd-logind[1390]: Session 16 logged out. Waiting for processes to exit. Sep 12 17:45:06.498203 systemd[1]: Started sshd@16-10.0.0.158:22-10.0.0.1:48058.service - OpenSSH per-connection server daemon (10.0.0.1:48058). Sep 12 17:45:06.499155 systemd-logind[1390]: Removed session 16. Sep 12 17:45:06.532671 sshd[2037]: Accepted publickey for core from 10.0.0.1 port 48058 ssh2: RSA SHA256:/3iCKt022AmlyeTJlfGC2G4n7imjC85tKhX8vqxRig4 Sep 12 17:45:06.534479 sshd[2037]: pam_unix(sshd:session): session opened for user core(uid=500) by core(uid=0) Sep 12 17:45:06.539153 systemd-logind[1390]: New session 17 of user core. Sep 12 17:45:06.549033 systemd[1]: Started session-17.scope - Session 17 of User core. Sep 12 17:45:06.611964 sshd[2037]: pam_unix(sshd:session): session closed for user core Sep 12 17:45:06.634280 systemd[1]: sshd@16-10.0.0.158:22-10.0.0.1:48058.service: Deactivated successfully. Sep 12 17:45:06.636484 systemd[1]: session-17.scope: Deactivated successfully. Sep 12 17:45:06.638353 systemd-logind[1390]: Session 17 logged out. Waiting for processes to exit. Sep 12 17:45:06.648229 systemd[1]: Started sshd@17-10.0.0.158:22-10.0.0.1:48062.service - OpenSSH per-connection server daemon (10.0.0.1:48062). Sep 12 17:45:06.649276 systemd-logind[1390]: Removed session 17. Sep 12 17:45:06.677132 sshd[2051]: Accepted publickey for core from 10.0.0.1 port 48062 ssh2: RSA SHA256:/3iCKt022AmlyeTJlfGC2G4n7imjC85tKhX8vqxRig4 Sep 12 17:45:06.679256 sshd[2051]: pam_unix(sshd:session): session opened for user core(uid=500) by core(uid=0) Sep 12 17:45:06.683922 systemd-logind[1390]: New session 18 of user core. Sep 12 17:45:06.702095 systemd[1]: Started session-18.scope - Session 18 of User core. Sep 12 17:45:06.781495 systemd[1]: var-lib-docker-overlay2-532482cd3c8623beede665400e09408687ef29fd6d88dbe322c71a3c46a7edfb\x2dinit-merged.mount: Deactivated successfully. Sep 12 17:45:06.808332 kernel: docker0: port 1(veth6d9d569) entered blocking state Sep 12 17:45:06.808599 kernel: docker0: port 1(veth6d9d569) entered disabled state Sep 12 17:45:06.810891 kernel: veth6d9d569: entered allmulticast mode Sep 12 17:45:06.810937 kernel: veth6d9d569: entered promiscuous mode Sep 12 17:45:06.812987 systemd-networkd[1333]: veth6d9d569: Link UP Sep 12 17:45:06.854650 containerd[1835]: time="2025-09-12T17:45:06.854538375Z" level=info msg="loading plugin \"io.containerd.event.v1.publisher\"..." runtime=io.containerd.runc.v2 type=io.containerd.event.v1 Sep 12 17:45:06.854650 containerd[1835]: time="2025-09-12T17:45:06.854626915Z" level=info msg="loading plugin \"io.containerd.internal.v1.shutdown\"..." runtime=io.containerd.runc.v2 type=io.containerd.internal.v1 Sep 12 17:45:06.854650 containerd[1835]: time="2025-09-12T17:45:06.854638899Z" level=info msg="loading plugin \"io.containerd.ttrpc.v1.task\"..." runtime=io.containerd.runc.v2 type=io.containerd.ttrpc.v1 Sep 12 17:45:06.855201 containerd[1835]: time="2025-09-12T17:45:06.854731517Z" level=info msg="loading plugin \"io.containerd.ttrpc.v1.pause\"..." runtime=io.containerd.runc.v2 type=io.containerd.ttrpc.v1 Sep 12 17:45:06.874999 systemd[1]: Started docker-8d0d207873c6451e466d283de0b06a6de114ef4e8a4620ec116759598cc7eb5b.scope - libcontainer container 8d0d207873c6451e466d283de0b06a6de114ef4e8a4620ec116759598cc7eb5b. Sep 12 17:45:06.948872 kernel: eth0: renamed from vetha2e98c7 Sep 12 17:45:06.958266 kernel: docker0: port 1(veth6d9d569) entered blocking state Sep 12 17:45:06.958345 kernel: docker0: port 1(veth6d9d569) entered forwarding state Sep 12 17:45:06.958369 systemd-networkd[1333]: veth6d9d569: Gained carrier Sep 12 17:45:06.958689 systemd-networkd[1333]: docker0: Gained carrier Sep 12 17:45:06.964264 systemd-resolved[1276]: Failed to determine the local hostname and LLMNR/mDNS names, ignoring: No such device or address Sep 12 17:45:07.004005 sshd[2051]: pam_unix(sshd:session): session closed for user core Sep 12 17:45:07.015949 systemd[1]: sshd@17-10.0.0.158:22-10.0.0.1:48062.service: Deactivated successfully. Sep 12 17:45:07.017960 systemd[1]: session-18.scope: Deactivated successfully. Sep 12 17:45:07.018747 systemd-logind[1390]: Session 18 logged out. Waiting for processes to exit. Sep 12 17:45:07.033301 systemd[1]: Started sshd@18-10.0.0.158:22-10.0.0.1:48078.service - OpenSSH per-connection server daemon (10.0.0.1:48078). Sep 12 17:45:07.034138 systemd-logind[1390]: Removed session 18. Sep 12 17:45:07.062481 sshd[2128]: Accepted publickey for core from 10.0.0.1 port 48078 ssh2: RSA SHA256:/3iCKt022AmlyeTJlfGC2G4n7imjC85tKhX8vqxRig4 Sep 12 17:45:07.064369 sshd[2128]: pam_unix(sshd:session): session opened for user core(uid=500) by core(uid=0) Sep 12 17:45:07.069117 systemd-logind[1390]: New session 19 of user core. Sep 12 17:45:07.084167 systemd[1]: Started session-19.scope - Session 19 of User core. Sep 12 17:45:07.143519 sshd[2128]: pam_unix(sshd:session): session closed for user core Sep 12 17:45:07.157673 systemd[1]: sshd@18-10.0.0.158:22-10.0.0.1:48078.service: Deactivated successfully. Sep 12 17:45:07.159851 systemd[1]: session-19.scope: Deactivated successfully. Sep 12 17:45:07.160560 systemd-logind[1390]: Session 19 logged out. Waiting for processes to exit. Sep 12 17:45:07.162624 systemd[1]: Started sshd@19-10.0.0.158:22-10.0.0.1:48086.service - OpenSSH per-connection server daemon (10.0.0.1:48086). Sep 12 17:45:07.163421 systemd-logind[1390]: Removed session 19. Sep 12 17:45:07.197766 sshd[2135]: Accepted publickey for core from 10.0.0.1 port 48086 ssh2: RSA SHA256:/3iCKt022AmlyeTJlfGC2G4n7imjC85tKhX8vqxRig4 Sep 12 17:45:07.199327 sshd[2135]: pam_unix(sshd:session): session opened for user core(uid=500) by core(uid=0) Sep 12 17:45:07.204395 systemd-logind[1390]: New session 20 of user core. Sep 12 17:45:07.219999 systemd[1]: Started session-20.scope - Session 20 of User core. Sep 12 17:45:07.274641 sudo[2138]: core : PWD=/home/core ; USER=root ; COMMAND=/usr/bin/kill -SIGHUP 1835 Sep 12 17:45:07.275004 sudo[2138]: pam_unix(sudo:session): session opened for user root(uid=0) by core(uid=500) Sep 12 17:45:07.278908 sudo[2138]: pam_unix(sudo:session): session closed for user root Sep 12 17:45:07.281229 sshd[2135]: pam_unix(sshd:session): session closed for user core Sep 12 17:45:07.284452 dockerd[1871]: time="2025-09-12T17:45:07.284344773Z" level=error msg="Failed to get event" error="rpc error: code = Unavailable desc = error reading from server: EOF" module=libcontainerd namespace=moby Sep 12 17:45:07.284452 dockerd[1871]: time="2025-09-12T17:45:07.284394990Z" level=info msg="Waiting for containerd to be ready to restart event processing" module=libcontainerd namespace=moby Sep 12 17:45:07.295169 dockerd[1871]: time="2025-09-12T17:45:07.284757224Z" level=error msg="Failed to get event" error="rpc error: code = Unavailable desc = error reading from server: EOF" module=libcontainerd namespace=plugins.moby Sep 12 17:45:07.295169 dockerd[1871]: time="2025-09-12T17:45:07.284781601Z" level=info msg="Waiting for containerd to be ready to restart event processing" module=libcontainerd namespace=plugins.moby Sep 12 17:45:07.298393 systemd[1]: containerd.service: Deactivated successfully. Sep 12 17:45:07.298488 systemd[1]: containerd.service: Unit process 2081 (containerd-shim) remains running after unit stopped. Sep 12 17:45:07.299438 systemd[1]: sshd@19-10.0.0.158:22-10.0.0.1:48086.service: Deactivated successfully. Sep 12 17:45:07.301690 systemd[1]: session-20.scope: Deactivated successfully. Sep 12 17:45:07.303596 systemd-logind[1390]: Session 20 logged out. Waiting for processes to exit. Sep 12 17:45:07.315371 systemd[1]: Started sshd@20-10.0.0.158:22-10.0.0.1:48096.service - OpenSSH per-connection server daemon (10.0.0.1:48096). Sep 12 17:45:07.316300 systemd-logind[1390]: Removed session 20. Sep 12 17:45:07.343001 sshd[2144]: Accepted publickey for core from 10.0.0.1 port 48096 ssh2: RSA SHA256:/3iCKt022AmlyeTJlfGC2G4n7imjC85tKhX8vqxRig4 Sep 12 17:45:07.345071 sshd[2144]: pam_unix(sshd:session): session opened for user core(uid=500) by core(uid=0) Sep 12 17:45:07.349718 systemd-logind[1390]: New session 21 of user core. Sep 12 17:45:07.359001 systemd[1]: Started session-21.scope - Session 21 of User core. Sep 12 17:45:07.417794 sshd[2144]: pam_unix(sshd:session): session closed for user core Sep 12 17:45:07.421337 systemd[1]: sshd@20-10.0.0.158:22-10.0.0.1:48096.service: Deactivated successfully. Sep 12 17:45:07.423101 systemd[1]: session-21.scope: Deactivated successfully. Sep 12 17:45:07.423734 systemd-logind[1390]: Session 21 logged out. Waiting for processes to exit. Sep 12 17:45:07.424698 systemd-logind[1390]: Removed session 21. Sep 12 17:45:09.008058 systemd-networkd[1333]: veth6d9d569: Gained IPv6LL Sep 12 17:45:12.350737 systemd[1]: containerd.service: Scheduled restart job, restart counter is at 2. Sep 12 17:45:12.351330 systemd[1]: Stopping docker.service - Docker Application Container Engine... Sep 12 17:45:12.351538 dockerd[1871]: time="2025-09-12T17:45:12.351449424Z" level=info msg="Processing signal 'terminated'" Sep 12 17:45:13.433476 systemd[1]: Started sshd@21-10.0.0.158:22-10.0.0.1:36426.service - OpenSSH per-connection server daemon (10.0.0.1:36426). Sep 12 17:45:13.466886 sshd[2151]: Accepted publickey for core from 10.0.0.1 port 36426 ssh2: RSA SHA256:/3iCKt022AmlyeTJlfGC2G4n7imjC85tKhX8vqxRig4 Sep 12 17:45:13.468393 sshd[2151]: pam_unix(sshd:session): session opened for user core(uid=500) by core(uid=0) Sep 12 17:45:13.472709 systemd-logind[1390]: New session 22 of user core. Sep 12 17:45:13.480981 systemd[1]: Started session-22.scope - Session 22 of User core. Sep 12 17:45:13.541753 sshd[2151]: pam_unix(sshd:session): session closed for user core Sep 12 17:45:13.545754 systemd[1]: sshd@21-10.0.0.158:22-10.0.0.1:36426.service: Deactivated successfully. Sep 12 17:45:13.548071 systemd[1]: session-22.scope: Deactivated successfully. Sep 12 17:45:13.548711 systemd-logind[1390]: Session 22 logged out. Waiting for processes to exit. Sep 12 17:45:13.549565 systemd-logind[1390]: Removed session 22. Sep 12 17:45:14.353405 dockerd[1871]: time="2025-09-12T17:45:14.353322926Z" level=error msg="Error sending stop (signal 15) to container" container=8d0d207873c6451e466d283de0b06a6de114ef4e8a4620ec116759598cc7eb5b error="Cannot kill container 8d0d207873c6451e466d283de0b06a6de114ef4e8a4620ec116759598cc7eb5b: connection error: desc = \"transport: Error while dialing: dial unix /var/run/docker/libcontainerd/docker-containerd.sock: connect: connection refused\": unavailable" Sep 12 17:45:14.353405 dockerd[1871]: time="2025-09-12T17:45:14.353392609Z" level=info msg="Container failed to exit within 2s of signal 15 - using the force" container=8d0d207873c6451e466d283de0b06a6de114ef4e8a4620ec116759598cc7eb5b Sep 12 17:45:15.385574 update_engine[1393]: I20250912 17:45:15.385480 1393 update_attempter.cc:509] Updating boot flags... Sep 12 17:45:15.413881 kernel: BTRFS warning: duplicate device /dev/vda3 devid 1 generation 34 scanned by (udev-worker) (2164) Sep 12 17:45:15.440866 kernel: BTRFS warning: duplicate device /dev/vda3 devid 1 generation 34 scanned by (udev-worker) (2168) Sep 12 17:45:15.471201 kernel: BTRFS warning: duplicate device /dev/vda3 devid 1 generation 34 scanned by (udev-worker) (2168) Sep 12 17:45:19.552863 systemd[1]: Started sshd@22-10.0.0.158:22-10.0.0.1:36440.service - OpenSSH per-connection server daemon (10.0.0.1:36440). Sep 12 17:45:19.583593 sshd[2173]: Accepted publickey for core from 10.0.0.1 port 36440 ssh2: RSA SHA256:/3iCKt022AmlyeTJlfGC2G4n7imjC85tKhX8vqxRig4 Sep 12 17:45:19.585101 sshd[2173]: pam_unix(sshd:session): session opened for user core(uid=500) by core(uid=0) Sep 12 17:45:19.588855 systemd-logind[1390]: New session 23 of user core. Sep 12 17:45:19.597977 systemd[1]: Started session-23.scope - Session 23 of User core. Sep 12 17:45:19.654926 sshd[2173]: pam_unix(sshd:session): session closed for user core Sep 12 17:45:19.659055 systemd[1]: sshd@22-10.0.0.158:22-10.0.0.1:36440.service: Deactivated successfully. Sep 12 17:45:19.661370 systemd[1]: session-23.scope: Deactivated successfully. Sep 12 17:45:19.661994 systemd-logind[1390]: Session 23 logged out. Waiting for processes to exit. Sep 12 17:45:19.662768 systemd-logind[1390]: Removed session 23. Sep 12 17:45:24.354582 dockerd[1871]: time="2025-09-12T17:45:24.354482489Z" level=warning msg="Container failed to exit within 10s of kill - trying direct SIGKILL" container=8d0d207873c6451e466d283de0b06a6de114ef4e8a4620ec116759598cc7eb5b error="context deadline exceeded" Sep 12 17:45:24.355310 systemd[1]: docker-8d0d207873c6451e466d283de0b06a6de114ef4e8a4620ec116759598cc7eb5b.scope: Deactivated successfully. Sep 12 17:45:25.669797 systemd[1]: Started sshd@23-10.0.0.158:22-10.0.0.1:43016.service - OpenSSH per-connection server daemon (10.0.0.1:43016). Sep 12 17:45:25.704115 sshd[2180]: Accepted publickey for core from 10.0.0.1 port 43016 ssh2: RSA SHA256:/3iCKt022AmlyeTJlfGC2G4n7imjC85tKhX8vqxRig4 Sep 12 17:45:25.705809 sshd[2180]: pam_unix(sshd:session): session opened for user core(uid=500) by core(uid=0) Sep 12 17:45:25.709550 systemd-logind[1390]: New session 24 of user core. Sep 12 17:45:25.718967 systemd[1]: Started session-24.scope - Session 24 of User core. Sep 12 17:45:25.775966 sshd[2180]: pam_unix(sshd:session): session closed for user core Sep 12 17:45:25.780668 systemd[1]: sshd@23-10.0.0.158:22-10.0.0.1:43016.service: Deactivated successfully. Sep 12 17:45:25.782956 systemd[1]: session-24.scope: Deactivated successfully. Sep 12 17:45:25.783690 systemd-logind[1390]: Session 24 logged out. Waiting for processes to exit. Sep 12 17:45:25.784602 systemd-logind[1390]: Removed session 24. Sep 12 17:45:27.352308 dockerd[1871]: time="2025-09-12T17:45:27.352226049Z" level=error msg="Force shutdown daemon" Sep 12 17:45:27.352793 dockerd[1871]: time="2025-09-12T17:45:27.352555701Z" level=info msg="Daemon shutdown complete" Sep 12 17:45:27.359076 systemd[1]: docker.service: Deactivated successfully. Sep 12 17:45:27.359478 systemd[1]: Stopped docker.service - Docker Application Container Engine. Sep 12 17:45:27.360130 systemd[1]: docker.socket: Deactivated successfully. Sep 12 17:45:27.360473 systemd[1]: Closed docker.socket - Docker Socket for the API. Sep 12 17:45:27.360526 systemd[1]: Stopping docker.socket - Docker Socket for the API... Sep 12 17:45:27.362827 systemd[1]: Starting docker.socket - Docker Socket for the API... Sep 12 17:45:27.363035 systemd[1]: containerd.service: Found left-over process 2081 (containerd-shim) in control group while starting unit. Ignoring. Sep 12 17:45:27.363046 systemd[1]: containerd.service: This usually indicates unclean termination of a previous run, or service implementation deficiencies. Sep 12 17:45:27.371072 systemd[1]: Starting containerd.service - containerd container runtime... Sep 12 17:45:27.372117 systemd[1]: Listening on docker.socket - Docker Socket for the API. Sep 12 17:45:27.384227 systemd[1]: containerd.service: Found left-over process 2081 (containerd-shim) in control group while starting unit. Ignoring. Sep 12 17:45:27.384238 systemd[1]: containerd.service: This usually indicates unclean termination of a previous run, or service implementation deficiencies. Sep 12 17:45:27.390314 (ntainerd)[2192]: containerd.service: Referenced but unset environment variable evaluates to an empty string: TORCX_IMAGEDIR, TORCX_UNPACKDIR Sep 12 17:45:27.409695 containerd[2192]: time="2025-09-12T17:45:27.409616269Z" level=info msg="starting containerd" revision=174e0d1785eeda18dc2beba45e1d5a188771636b version=v1.7.21 Sep 12 17:45:27.433021 containerd[2192]: time="2025-09-12T17:45:27.432966937Z" level=info msg="loading plugin \"io.containerd.snapshotter.v1.aufs\"..." type=io.containerd.snapshotter.v1 Sep 12 17:45:27.434736 containerd[2192]: time="2025-09-12T17:45:27.434690541Z" level=info msg="skip loading plugin \"io.containerd.snapshotter.v1.aufs\"..." error="aufs is not supported (modprobe aufs failed: exit status 1 \"modprobe: FATAL: Module aufs not found in directory /lib/modules/6.6.106-flatcar\\n\"): skip plugin" type=io.containerd.snapshotter.v1 Sep 12 17:45:27.434736 containerd[2192]: time="2025-09-12T17:45:27.434729134Z" level=info msg="loading plugin \"io.containerd.event.v1.exchange\"..." type=io.containerd.event.v1 Sep 12 17:45:27.434810 containerd[2192]: time="2025-09-12T17:45:27.434748230Z" level=info msg="loading plugin \"io.containerd.internal.v1.opt\"..." type=io.containerd.internal.v1 Sep 12 17:45:27.434810 containerd[2192]: time="2025-09-12T17:45:27.434782174Z" level=info msg="loading plugin \"io.containerd.warning.v1.deprecations\"..." type=io.containerd.warning.v1 Sep 12 17:45:27.434810 containerd[2192]: time="2025-09-12T17:45:27.434797432Z" level=info msg="loading plugin \"io.containerd.snapshotter.v1.blockfile\"..." type=io.containerd.snapshotter.v1 Sep 12 17:45:27.434893 containerd[2192]: time="2025-09-12T17:45:27.434824354Z" level=info msg="skip loading plugin \"io.containerd.snapshotter.v1.blockfile\"..." error="no scratch file generator: skip plugin" type=io.containerd.snapshotter.v1 Sep 12 17:45:27.434893 containerd[2192]: time="2025-09-12T17:45:27.434853228Z" level=info msg="loading plugin \"io.containerd.snapshotter.v1.btrfs\"..." type=io.containerd.snapshotter.v1 Sep 12 17:45:27.435077 containerd[2192]: time="2025-09-12T17:45:27.435047845Z" 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 Sep 12 17:45:27.435077 containerd[2192]: time="2025-09-12T17:45:27.435067473Z" level=info msg="loading plugin \"io.containerd.snapshotter.v1.devmapper\"..." type=io.containerd.snapshotter.v1 Sep 12 17:45:27.435126 containerd[2192]: time="2025-09-12T17:45:27.435082812Z" level=info msg="skip loading plugin \"io.containerd.snapshotter.v1.devmapper\"..." error="devmapper not configured: skip plugin" type=io.containerd.snapshotter.v1 Sep 12 17:45:27.435126 containerd[2192]: time="2025-09-12T17:45:27.435093922Z" level=info msg="loading plugin \"io.containerd.snapshotter.v1.native\"..." type=io.containerd.snapshotter.v1 Sep 12 17:45:27.435126 containerd[2192]: time="2025-09-12T17:45:27.435119120Z" level=info msg="loading plugin \"io.containerd.snapshotter.v1.overlayfs\"..." type=io.containerd.snapshotter.v1 Sep 12 17:45:27.435250 containerd[2192]: time="2025-09-12T17:45:27.435227124Z" level=info msg="loading plugin \"io.containerd.snapshotter.v1.zfs\"..." type=io.containerd.snapshotter.v1 Sep 12 17:45:27.435411 containerd[2192]: time="2025-09-12T17:45:27.435385162Z" 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 Sep 12 17:45:27.435411 containerd[2192]: time="2025-09-12T17:45:27.435402445Z" level=info msg="loading plugin \"io.containerd.content.v1.content\"..." type=io.containerd.content.v1 Sep 12 17:45:27.435457 containerd[2192]: time="2025-09-12T17:45:27.435424206Z" level=info msg="loading plugin \"io.containerd.metadata.v1.bolt\"..." type=io.containerd.metadata.v1 Sep 12 17:45:27.435457 containerd[2192]: time="2025-09-12T17:45:27.435441679Z" level=info msg="metadata content store policy set" policy=shared Sep 12 17:45:27.435657 containerd[2192]: time="2025-09-12T17:45:27.435632168Z" level=info msg="loading plugin \"io.containerd.gc.v1.scheduler\"..." type=io.containerd.gc.v1 Sep 12 17:45:27.435692 containerd[2192]: time="2025-09-12T17:45:27.435665291Z" level=info msg="loading plugin \"io.containerd.differ.v1.walking\"..." type=io.containerd.differ.v1 Sep 12 17:45:27.435692 containerd[2192]: time="2025-09-12T17:45:27.435681742Z" level=info msg="loading plugin \"io.containerd.lease.v1.manager\"..." type=io.containerd.lease.v1 Sep 12 17:45:27.435736 containerd[2192]: time="2025-09-12T17:45:27.435699235Z" level=info msg="loading plugin \"io.containerd.streaming.v1.manager\"..." type=io.containerd.streaming.v1 Sep 12 17:45:27.435736 containerd[2192]: time="2025-09-12T17:45:27.435715445Z" level=info msg="loading plugin \"io.containerd.runtime.v1.linux\"..." type=io.containerd.runtime.v1 Sep 12 17:45:27.435793 containerd[2192]: time="2025-09-12T17:45:27.435776150Z" level=info msg="loading plugin \"io.containerd.monitor.v1.cgroups\"..." type=io.containerd.monitor.v1 Sep 12 17:45:27.436086 containerd[2192]: time="2025-09-12T17:45:27.436060386Z" level=info msg="loading plugin \"io.containerd.runtime.v2.task\"..." type=io.containerd.runtime.v2 Sep 12 17:45:27.444115 containerd[2192]: time="2025-09-12T17:45:27.444090093Z" level=info msg="cleaning leaked shim process" id=8d0d207873c6451e466d283de0b06a6de114ef4e8a4620ec116759598cc7eb5b namespace=moby Sep 12 17:45:27.453567 containerd[2192]: time="2025-09-12T17:45:27.453490449Z" level=error msg="post event" error="failed to connect: dial unix /run/containerd/containerd.sock.ttrpc: connect: connection refused" Sep 12 17:45:27.453823 containerd[2192]: time="2025-09-12T17:45:27.453755228Z" level=info msg="shim disconnected" id=8d0d207873c6451e466d283de0b06a6de114ef4e8a4620ec116759598cc7eb5b namespace=moby Sep 12 17:45:27.453866 containerd[2192]: time="2025-09-12T17:45:27.453823367Z" level=warning msg="cleaning up after shim disconnected" id=8d0d207873c6451e466d283de0b06a6de114ef4e8a4620ec116759598cc7eb5b namespace=moby Sep 12 17:45:27.453866 containerd[2192]: time="2025-09-12T17:45:27.453833236Z" level=info msg="cleaning up dead shim" namespace=moby Sep 12 17:45:27.467151 containerd[2192]: time="2025-09-12T17:45:27.467102913Z" level=info msg="loading plugin \"io.containerd.runtime.v2.shim\"..." type=io.containerd.runtime.v2 Sep 12 17:45:27.467151 containerd[2192]: time="2025-09-12T17:45:27.467147438Z" level=info msg="loading plugin \"io.containerd.sandbox.store.v1.local\"..." type=io.containerd.sandbox.store.v1 Sep 12 17:45:27.467151 containerd[2192]: time="2025-09-12T17:45:27.467161955Z" level=info msg="loading plugin \"io.containerd.sandbox.controller.v1.local\"..." type=io.containerd.sandbox.controller.v1 Sep 12 17:45:27.467330 containerd[2192]: time="2025-09-12T17:45:27.467177414Z" level=info msg="loading plugin \"io.containerd.service.v1.containers-service\"..." type=io.containerd.service.v1 Sep 12 17:45:27.467330 containerd[2192]: time="2025-09-12T17:45:27.467191902Z" level=info msg="loading plugin \"io.containerd.service.v1.content-service\"..." type=io.containerd.service.v1 Sep 12 17:45:27.467330 containerd[2192]: time="2025-09-12T17:45:27.467204606Z" level=info msg="loading plugin \"io.containerd.service.v1.diff-service\"..." type=io.containerd.service.v1 Sep 12 17:45:27.467330 containerd[2192]: time="2025-09-12T17:45:27.467220205Z" level=info msg="loading plugin \"io.containerd.service.v1.images-service\"..." type=io.containerd.service.v1 Sep 12 17:45:27.467330 containerd[2192]: time="2025-09-12T17:45:27.467236887Z" level=info msg="loading plugin \"io.containerd.service.v1.introspection-service\"..." type=io.containerd.service.v1 Sep 12 17:45:27.467330 containerd[2192]: time="2025-09-12T17:45:27.467253728Z" level=info msg="loading plugin \"io.containerd.service.v1.namespaces-service\"..." type=io.containerd.service.v1 Sep 12 17:45:27.467330 containerd[2192]: time="2025-09-12T17:45:27.467268877Z" level=info msg="loading plugin \"io.containerd.service.v1.snapshots-service\"..." type=io.containerd.service.v1 Sep 12 17:45:27.467330 containerd[2192]: time="2025-09-12T17:45:27.467280850Z" level=info msg="loading plugin \"io.containerd.service.v1.tasks-service\"..." type=io.containerd.service.v1 Sep 12 17:45:27.467330 containerd[2192]: time="2025-09-12T17:45:27.467302280Z" level=info msg="loading plugin \"io.containerd.grpc.v1.containers\"..." type=io.containerd.grpc.v1 Sep 12 17:45:27.467330 containerd[2192]: time="2025-09-12T17:45:27.467315716Z" level=info msg="loading plugin \"io.containerd.grpc.v1.content\"..." type=io.containerd.grpc.v1 Sep 12 17:45:27.467330 containerd[2192]: time="2025-09-12T17:45:27.467328540Z" level=info msg="loading plugin \"io.containerd.grpc.v1.diff\"..." type=io.containerd.grpc.v1 Sep 12 17:45:27.467593 containerd[2192]: time="2025-09-12T17:45:27.467342826Z" level=info msg="loading plugin \"io.containerd.grpc.v1.events\"..." type=io.containerd.grpc.v1 Sep 12 17:45:27.467593 containerd[2192]: time="2025-09-12T17:45:27.467354578Z" level=info msg="loading plugin \"io.containerd.grpc.v1.images\"..." type=io.containerd.grpc.v1 Sep 12 17:45:27.467593 containerd[2192]: time="2025-09-12T17:45:27.467367464Z" level=info msg="loading plugin \"io.containerd.grpc.v1.introspection\"..." type=io.containerd.grpc.v1 Sep 12 17:45:27.467593 containerd[2192]: time="2025-09-12T17:45:27.467380648Z" level=info msg="loading plugin \"io.containerd.grpc.v1.leases\"..." type=io.containerd.grpc.v1 Sep 12 17:45:27.467593 containerd[2192]: time="2025-09-12T17:45:27.467393112Z" level=info msg="loading plugin \"io.containerd.grpc.v1.namespaces\"..." type=io.containerd.grpc.v1 Sep 12 17:45:27.467593 containerd[2192]: time="2025-09-12T17:45:27.467405144Z" level=info msg="loading plugin \"io.containerd.grpc.v1.sandbox-controllers\"..." type=io.containerd.grpc.v1 Sep 12 17:45:27.467593 containerd[2192]: time="2025-09-12T17:45:27.467419541Z" level=info msg="loading plugin \"io.containerd.grpc.v1.sandboxes\"..." type=io.containerd.grpc.v1 Sep 12 17:45:27.467593 containerd[2192]: time="2025-09-12T17:45:27.467430843Z" level=info msg="loading plugin \"io.containerd.grpc.v1.snapshots\"..." type=io.containerd.grpc.v1 Sep 12 17:45:27.467593 containerd[2192]: time="2025-09-12T17:45:27.467442856Z" level=info msg="loading plugin \"io.containerd.grpc.v1.streaming\"..." type=io.containerd.grpc.v1 Sep 12 17:45:27.467593 containerd[2192]: time="2025-09-12T17:45:27.467455279Z" level=info msg="loading plugin \"io.containerd.grpc.v1.tasks\"..." type=io.containerd.grpc.v1 Sep 12 17:45:27.467593 containerd[2192]: time="2025-09-12T17:45:27.467471460Z" level=info msg="loading plugin \"io.containerd.transfer.v1.local\"..." type=io.containerd.transfer.v1 Sep 12 17:45:27.467593 containerd[2192]: time="2025-09-12T17:45:27.467495034Z" level=info msg="loading plugin \"io.containerd.grpc.v1.transfer\"..." type=io.containerd.grpc.v1 Sep 12 17:45:27.467593 containerd[2192]: time="2025-09-12T17:45:27.467506766Z" level=info msg="loading plugin \"io.containerd.grpc.v1.version\"..." type=io.containerd.grpc.v1 Sep 12 17:45:27.467593 containerd[2192]: time="2025-09-12T17:45:27.467529510Z" level=info msg="loading plugin \"io.containerd.internal.v1.restart\"..." type=io.containerd.internal.v1 Sep 12 17:45:27.467928 containerd[2192]: time="2025-09-12T17:45:27.467579243Z" level=info msg="loading plugin \"io.containerd.tracing.processor.v1.otlp\"..." type=io.containerd.tracing.processor.v1 Sep 12 17:45:27.467928 containerd[2192]: time="2025-09-12T17:45:27.467597146Z" level=info msg="skip loading plugin \"io.containerd.tracing.processor.v1.otlp\"..." error="skip plugin: tracing endpoint not configured" type=io.containerd.tracing.processor.v1 Sep 12 17:45:27.467928 containerd[2192]: time="2025-09-12T17:45:27.467607587Z" level=info msg="loading plugin \"io.containerd.internal.v1.tracing\"..." type=io.containerd.internal.v1 Sep 12 17:45:27.467928 containerd[2192]: time="2025-09-12T17:45:27.467619279Z" level=info msg="skip loading plugin \"io.containerd.internal.v1.tracing\"..." error="skip plugin: tracing endpoint not configured" type=io.containerd.internal.v1 Sep 12 17:45:27.467928 containerd[2192]: time="2025-09-12T17:45:27.467629037Z" level=info msg="loading plugin \"io.containerd.grpc.v1.healthcheck\"..." type=io.containerd.grpc.v1 Sep 12 17:45:27.467928 containerd[2192]: time="2025-09-12T17:45:27.467641090Z" level=info msg="loading plugin \"io.containerd.nri.v1.nri\"..." type=io.containerd.nri.v1 Sep 12 17:45:27.467928 containerd[2192]: time="2025-09-12T17:45:27.467651519Z" level=info msg="NRI interface is disabled by configuration." Sep 12 17:45:27.467928 containerd[2192]: time="2025-09-12T17:45:27.467661749Z" level=info msg="loading plugin \"io.containerd.grpc.v1.cri\"..." type=io.containerd.grpc.v1 Sep 12 17:45:27.468108 containerd[2192]: time="2025-09-12T17:45:27.467910719Z" level=info msg="Start cri plugin with config {PluginConfig:{ContainerdConfig:{Snapshotter:overlayfs DefaultRuntimeName:runc DefaultRuntime:{Type: Path: Engine: PodAnnotations:[] ContainerAnnotations:[] Root: Options:map[] PrivilegedWithoutHostDevices:false PrivilegedWithoutHostDevicesAllDevicesAllowed:false BaseRuntimeSpec: NetworkPluginConfDir: NetworkPluginMaxConfNum:0 Snapshotter: SandboxMode:} UntrustedWorkloadRuntime:{Type: Path: Engine: PodAnnotations:[] ContainerAnnotations:[] Root: Options:map[] PrivilegedWithoutHostDevices:false PrivilegedWithoutHostDevicesAllDevicesAllowed:false BaseRuntimeSpec: NetworkPluginConfDir: NetworkPluginMaxConfNum:0 Snapshotter: SandboxMode:} Runtimes:map[runc:{Type:io.containerd.runc.v2 Path: Engine: PodAnnotations:[] ContainerAnnotations:[] Root: Options:map[SystemdCgroup:true] PrivilegedWithoutHostDevices:false PrivilegedWithoutHostDevicesAllDevicesAllowed:false BaseRuntimeSpec: NetworkPluginConfDir: NetworkPluginMaxConfNum:0 Snapshotter: SandboxMode:podsandbox}] NoPivot:false DisableSnapshotAnnotations:true DiscardUnpackedLayers:false IgnoreBlockIONotEnabledErrors:false IgnoreRdtNotEnabledErrors:false} CniConfig:{NetworkPluginBinDir:/opt/cni/bin NetworkPluginConfDir:/etc/cni/net.d NetworkPluginMaxConfNum:1 NetworkPluginSetupSerially:false NetworkPluginConfTemplate: IPPreference:} Registry:{ConfigPath: Mirrors:map[] Configs:map[] Auths:map[] Headers:map[]} ImageDecryption:{KeyModel:node} DisableTCPService:true StreamServerAddress:127.0.0.1 StreamServerPort:0 StreamIdleTimeout:4h0m0s EnableSelinux:true SelinuxCategoryRange:1024 SandboxImage:registry.k8s.io/pause:3.8 StatsCollectPeriod:10 SystemdCgroup:false EnableTLSStreaming:false X509KeyPairStreaming:{TLSCertFile: TLSKeyFile:} MaxContainerLogLineSize:16384 DisableCgroup:false DisableApparmor:false RestrictOOMScoreAdj:false MaxConcurrentDownloads:3 DisableProcMount:false UnsetSeccompProfile: TolerateMissingHugetlbController:true DisableHugetlbController:true DeviceOwnershipFromSecurityContext:false IgnoreImageDefinedVolumes:false NetNSMountsUnderStateDir:false EnableUnprivilegedPorts:false EnableUnprivilegedICMP:false EnableCDI:false CDISpecDirs:[/etc/cdi /var/run/cdi] ImagePullProgressTimeout:5m0s DrainExecSyncIOTimeout:0s ImagePullWithSyncFs:false IgnoreDeprecationWarnings:[]} ContainerdRootDir:/var/lib/containerd ContainerdEndpoint:/run/containerd/containerd.sock RootDir:/var/lib/containerd/io.containerd.grpc.v1.cri StateDir:/run/containerd/io.containerd.grpc.v1.cri}" Sep 12 17:45:27.468108 containerd[2192]: time="2025-09-12T17:45:27.467963839Z" level=info msg="Connect containerd service" Sep 12 17:45:27.468108 containerd[2192]: time="2025-09-12T17:45:27.467992784Z" level=info msg="using legacy CRI server" Sep 12 17:45:27.468108 containerd[2192]: time="2025-09-12T17:45:27.467999596Z" level=info msg="using experimental NRI integration - disable nri plugin to prevent this" Sep 12 17:45:27.468108 containerd[2192]: time="2025-09-12T17:45:27.468088394Z" level=info msg="Get image filesystem path \"/var/lib/containerd/io.containerd.snapshotter.v1.overlayfs\"" Sep 12 17:45:27.469299 containerd[2192]: time="2025-09-12T17:45:27.468732270Z" 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" Sep 12 17:45:27.469299 containerd[2192]: time="2025-09-12T17:45:27.469064938Z" level=info msg=serving... address=/run/containerd/containerd.sock.ttrpc Sep 12 17:45:27.469299 containerd[2192]: time="2025-09-12T17:45:27.469116024Z" level=info msg=serving... address=/run/containerd/containerd.sock Sep 12 17:45:27.469299 containerd[2192]: time="2025-09-12T17:45:27.469139919Z" level=info msg="Start subscribing containerd event" Sep 12 17:45:27.469299 containerd[2192]: time="2025-09-12T17:45:27.469174835Z" level=info msg="Start recovering state" Sep 12 17:45:27.469299 containerd[2192]: time="2025-09-12T17:45:27.469231001Z" level=info msg="Start event monitor" Sep 12 17:45:27.469299 containerd[2192]: time="2025-09-12T17:45:27.469246921Z" level=info msg="Start snapshots syncer" Sep 12 17:45:27.469299 containerd[2192]: time="2025-09-12T17:45:27.469257350Z" level=info msg="Start cni network conf syncer for default" Sep 12 17:45:27.469299 containerd[2192]: time="2025-09-12T17:45:27.469272349Z" level=info msg="Start streaming server" Sep 12 17:45:27.469621 systemd[1]: Started containerd.service - containerd container runtime. Sep 12 17:45:27.469894 containerd[2192]: time="2025-09-12T17:45:27.469864277Z" level=info msg="containerd successfully booted in 0.061868s" Sep 12 17:45:27.481084 systemd[1]: Starting docker.service - Docker Application Container Engine... Sep 12 17:45:27.481292 (dockerd)[2228]: docker.service: Referenced but unset environment variable evaluates to an empty string: DOCKER_CGROUPS, DOCKER_OPTS, DOCKER_OPT_BIP, DOCKER_OPT_IPMASQ, DOCKER_OPT_MTU Sep 12 17:45:27.524777 dockerd[2228]: time="2025-09-12T17:45:27.524712671Z" level=info msg="Starting up" Sep 12 17:45:27.556980 dockerd[2228]: time="2025-09-12T17:45:27.556937069Z" level=info msg="[graphdriver] using prior storage driver: overlay2" Sep 12 17:45:27.578452 dockerd[2228]: time="2025-09-12T17:45:27.578416444Z" level=info msg="Loading containers: start." Sep 12 17:45:27.595813 systemd[1]: var-lib-docker-overlay2-532482cd3c8623beede665400e09408687ef29fd6d88dbe322c71a3c46a7edfb-merged.mount: Deactivated successfully. Sep 12 17:45:27.780014 dockerd[2228]: time="2025-09-12T17:45:27.779894653Z" level=info msg="Removing stale sandbox 0effbd299d2d8da0bca37b1674f3c37bd3be345eb9a9faab334e546b584d7be6 (8d0d207873c6451e466d283de0b06a6de114ef4e8a4620ec116759598cc7eb5b)" Sep 12 17:45:27.785913 dockerd[2228]: time="2025-09-12T17:45:27.785875834Z" level=warning msg="Error (Unable to complete atomic operation, key modified) deleting object [endpoint 2b6fc6f0a31156a66f2a138e10f7438b1e3d685a664a0467026be5e3e897cb15 5c19b1432ae1bd314a5219a6c37a80bb09be78f6bd4270eb62c7b7cc4bd15597], retrying...." Sep 12 17:45:27.787140 systemd-networkd[1333]: veth6d9d569: Link DOWN Sep 12 17:45:27.787152 systemd-networkd[1333]: veth6d9d569: Lost carrier Sep 12 17:45:27.788872 kernel: docker0: port 1(veth6d9d569) entered disabled state Sep 12 17:45:27.788917 kernel: veth6d9d569 (unregistering): left allmulticast mode Sep 12 17:45:27.790119 kernel: veth6d9d569 (unregistering): left promiscuous mode Sep 12 17:45:27.790219 kernel: docker0: port 1(veth6d9d569) entered disabled state Sep 12 17:45:27.797025 systemd-networkd[1333]: docker0: Lost carrier Sep 12 17:45:27.905075 dockerd[2228]: time="2025-09-12T17:45:27.905024354Z" 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" Sep 12 17:45:27.960532 dockerd[2228]: time="2025-09-12T17:45:27.960479683Z" level=info msg="Loading containers: done." Sep 12 17:45:27.973452 dockerd[2228]: time="2025-09-12T17:45:27.973413959Z" 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 Sep 12 17:45:27.973621 dockerd[2228]: time="2025-09-12T17:45:27.973495232Z" level=info msg="Docker daemon" commit=061aa95809be396a6b5542618d8a34b02a21ff77 containerd-snapshotter=false storage-driver=overlay2 version=26.1.0 Sep 12 17:45:27.973621 dockerd[2228]: time="2025-09-12T17:45:27.973564373Z" level=info msg="Daemon has completed initialization" Sep 12 17:45:27.993785 dockerd[2228]: time="2025-09-12T17:45:27.993727524Z" level=info msg="API listen on /run/docker.sock" Sep 12 17:45:27.993881 systemd[1]: Started docker.service - Docker Application Container Engine. Sep 12 17:45:28.546313 systemd[1]: run-docker-netns-0effbd299d2d.mount: Deactivated successfully. Sep 12 17:45:31.789913 systemd[1]: Started sshd@24-10.0.0.158:22-10.0.0.1:60256.service - OpenSSH per-connection server daemon (10.0.0.1:60256). Sep 12 17:45:31.820488 sshd[2381]: Accepted publickey for core from 10.0.0.1 port 60256 ssh2: RSA SHA256:/3iCKt022AmlyeTJlfGC2G4n7imjC85tKhX8vqxRig4 Sep 12 17:45:31.821972 sshd[2381]: pam_unix(sshd:session): session opened for user core(uid=500) by core(uid=0) Sep 12 17:45:31.825580 systemd-logind[1390]: New session 25 of user core. Sep 12 17:45:31.834954 systemd[1]: Started session-25.scope - Session 25 of User core. Sep 12 17:45:31.891778 sshd[2381]: pam_unix(sshd:session): session closed for user core Sep 12 17:45:31.910932 systemd[1]: sshd@24-10.0.0.158:22-10.0.0.1:60256.service: Deactivated successfully. Sep 12 17:45:31.913046 systemd[1]: session-25.scope: Deactivated successfully. Sep 12 17:45:31.914485 systemd-logind[1390]: Session 25 logged out. Waiting for processes to exit. Sep 12 17:45:31.915826 systemd[1]: Started sshd@25-10.0.0.158:22-10.0.0.1:60258.service - OpenSSH per-connection server daemon (10.0.0.1:60258). Sep 12 17:45:31.916578 systemd-logind[1390]: Removed session 25. Sep 12 17:45:31.947733 sshd[2388]: Accepted publickey for core from 10.0.0.1 port 60258 ssh2: RSA SHA256:/3iCKt022AmlyeTJlfGC2G4n7imjC85tKhX8vqxRig4 Sep 12 17:45:31.949341 sshd[2388]: pam_unix(sshd:session): session opened for user core(uid=500) by core(uid=0) Sep 12 17:45:31.953155 systemd-logind[1390]: New session 26 of user core. Sep 12 17:45:31.962957 systemd[1]: Started session-26.scope - Session 26 of User core. Sep 12 17:45:32.019198 sshd[2388]: pam_unix(sshd:session): session closed for user core Sep 12 17:45:32.030790 systemd[1]: sshd@25-10.0.0.158:22-10.0.0.1:60258.service: Deactivated successfully. Sep 12 17:45:32.032490 systemd[1]: session-26.scope: Deactivated successfully. Sep 12 17:45:32.033830 systemd-logind[1390]: Session 26 logged out. Waiting for processes to exit. Sep 12 17:45:32.035111 systemd[1]: Started sshd@26-10.0.0.158:22-10.0.0.1:60264.service - OpenSSH per-connection server daemon (10.0.0.1:60264). Sep 12 17:45:32.035930 systemd-logind[1390]: Removed session 26. Sep 12 17:45:32.066657 sshd[2395]: Accepted publickey for core from 10.0.0.1 port 60264 ssh2: RSA SHA256:/3iCKt022AmlyeTJlfGC2G4n7imjC85tKhX8vqxRig4 Sep 12 17:45:32.068091 sshd[2395]: pam_unix(sshd:session): session opened for user core(uid=500) by core(uid=0) Sep 12 17:45:32.073349 systemd-logind[1390]: New session 27 of user core. Sep 12 17:45:32.086964 systemd[1]: Started session-27.scope - Session 27 of User core. Sep 12 17:45:32.146896 sshd[2395]: pam_unix(sshd:session): session closed for user core Sep 12 17:45:32.158855 systemd[1]: sshd@26-10.0.0.158:22-10.0.0.1:60264.service: Deactivated successfully. Sep 12 17:45:32.160927 systemd[1]: session-27.scope: Deactivated successfully. Sep 12 17:45:32.162653 systemd-logind[1390]: Session 27 logged out. Waiting for processes to exit. Sep 12 17:45:32.173104 systemd[1]: Started sshd@27-10.0.0.158:22-10.0.0.1:60278.service - OpenSSH per-connection server daemon (10.0.0.1:60278). Sep 12 17:45:32.174106 systemd-logind[1390]: Removed session 27. Sep 12 17:45:32.201727 sshd[2409]: Accepted publickey for core from 10.0.0.1 port 60278 ssh2: RSA SHA256:/3iCKt022AmlyeTJlfGC2G4n7imjC85tKhX8vqxRig4 Sep 12 17:45:32.203363 sshd[2409]: pam_unix(sshd:session): session opened for user core(uid=500) by core(uid=0) Sep 12 17:45:32.207098 systemd-logind[1390]: New session 28 of user core. Sep 12 17:45:32.217960 systemd[1]: Started session-28.scope - Session 28 of User core. Sep 12 17:45:32.290365 systemd[1]: var-lib-docker-overlay2-053eee74e691dc6d3aac2ca7d6683e7c5605cc633e9bfd8bf442a62eadab34b8\x2dinit-merged.mount: Deactivated successfully. Sep 12 17:45:32.317615 kernel: docker0: port 1(veth1ecf624) entered blocking state Sep 12 17:45:32.317770 kernel: docker0: port 1(veth1ecf624) entered disabled state Sep 12 17:45:32.320056 kernel: veth1ecf624: entered allmulticast mode Sep 12 17:45:32.320137 kernel: veth1ecf624: entered promiscuous mode Sep 12 17:45:32.320939 systemd-networkd[1333]: veth1ecf624: Link UP Sep 12 17:45:32.363547 containerd[2192]: time="2025-09-12T17:45:32.362967077Z" level=info msg="loading plugin \"io.containerd.event.v1.publisher\"..." runtime=io.containerd.runc.v2 type=io.containerd.event.v1 Sep 12 17:45:32.363547 containerd[2192]: time="2025-09-12T17:45:32.363535889Z" level=info msg="loading plugin \"io.containerd.internal.v1.shutdown\"..." runtime=io.containerd.runc.v2 type=io.containerd.internal.v1 Sep 12 17:45:32.364042 containerd[2192]: time="2025-09-12T17:45:32.363568109Z" level=info msg="loading plugin \"io.containerd.ttrpc.v1.task\"..." runtime=io.containerd.runc.v2 type=io.containerd.ttrpc.v1 Sep 12 17:45:32.364042 containerd[2192]: time="2025-09-12T17:45:32.363668218Z" level=info msg="loading plugin \"io.containerd.ttrpc.v1.pause\"..." runtime=io.containerd.runc.v2 type=io.containerd.ttrpc.v1 Sep 12 17:45:32.385982 systemd[1]: Started docker-80b607c9e52461879b6635874b1101d2c198d3ede2886c2a354eeea1d80de3b4.scope - libcontainer container 80b607c9e52461879b6635874b1101d2c198d3ede2886c2a354eeea1d80de3b4. Sep 12 17:45:32.456880 kernel: eth0: renamed from vethb17df9e Sep 12 17:45:32.467251 kernel: docker0: port 1(veth1ecf624) entered blocking state Sep 12 17:45:32.467338 kernel: docker0: port 1(veth1ecf624) entered forwarding state Sep 12 17:45:32.467382 systemd-networkd[1333]: veth1ecf624: Gained carrier Sep 12 17:45:32.467786 systemd-networkd[1333]: docker0: Gained carrier Sep 12 17:45:32.472475 systemd-resolved[1276]: Failed to determine the local hostname and LLMNR/mDNS names, ignoring: No such device or address Sep 12 17:45:32.509080 sshd[2409]: pam_unix(sshd:session): session closed for user core Sep 12 17:45:32.513642 systemd[1]: sshd@27-10.0.0.158:22-10.0.0.1:60278.service: Deactivated successfully. Sep 12 17:45:32.515483 systemd[1]: session-28.scope: Deactivated successfully. Sep 12 17:45:32.516161 systemd-logind[1390]: Session 28 logged out. Waiting for processes to exit. Sep 12 17:45:32.517255 systemd-logind[1390]: Removed session 28. Sep 12 17:45:34.032093 systemd-networkd[1333]: veth1ecf624: Gained IPv6LL