Nov 1 00:15:31.258125 kernel: Linux version 6.6.113-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 Oct 31 22:41:55 -00 2025 Nov 1 00:15:31.258157 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=ade41980c48607de3d2d18dc444731ec5388853e3a75ed2d5a13ce616b36f478 Nov 1 00:15:31.258173 kernel: BIOS-provided physical RAM map: Nov 1 00:15:31.258181 kernel: BIOS-e820: [mem 0x0000000000000000-0x000000000009ffff] usable Nov 1 00:15:31.258190 kernel: BIOS-e820: [mem 0x0000000000100000-0x00000000007fffff] usable Nov 1 00:15:31.258199 kernel: BIOS-e820: [mem 0x0000000000800000-0x0000000000807fff] ACPI NVS Nov 1 00:15:31.258209 kernel: BIOS-e820: [mem 0x0000000000808000-0x000000000080afff] usable Nov 1 00:15:31.258218 kernel: BIOS-e820: [mem 0x000000000080b000-0x000000000080bfff] ACPI NVS Nov 1 00:15:31.258227 kernel: BIOS-e820: [mem 0x000000000080c000-0x000000000080ffff] usable Nov 1 00:15:31.258235 kernel: BIOS-e820: [mem 0x0000000000810000-0x00000000008fffff] ACPI NVS Nov 1 00:15:31.258249 kernel: BIOS-e820: [mem 0x0000000000900000-0x000000009c8eefff] usable Nov 1 00:15:31.258258 kernel: BIOS-e820: [mem 0x000000009c8ef000-0x000000009c9eefff] reserved Nov 1 00:15:31.258272 kernel: BIOS-e820: [mem 0x000000009c9ef000-0x000000009caeefff] type 20 Nov 1 00:15:31.258281 kernel: BIOS-e820: [mem 0x000000009caef000-0x000000009cb6efff] reserved Nov 1 00:15:31.258295 kernel: BIOS-e820: [mem 0x000000009cb6f000-0x000000009cb7efff] ACPI data Nov 1 00:15:31.258305 kernel: BIOS-e820: [mem 0x000000009cb7f000-0x000000009cbfefff] ACPI NVS Nov 1 00:15:31.258319 kernel: BIOS-e820: [mem 0x000000009cbff000-0x000000009cf3ffff] usable Nov 1 00:15:31.258329 kernel: BIOS-e820: [mem 0x000000009cf40000-0x000000009cf5ffff] reserved Nov 1 00:15:31.258338 kernel: BIOS-e820: [mem 0x000000009cf60000-0x000000009cffffff] ACPI NVS Nov 1 00:15:31.258348 kernel: BIOS-e820: [mem 0x00000000b0000000-0x00000000bfffffff] reserved Nov 1 00:15:31.258357 kernel: NX (Execute Disable) protection: active Nov 1 00:15:31.258367 kernel: APIC: Static calls initialized Nov 1 00:15:31.258376 kernel: efi: EFI v2.7 by EDK II Nov 1 00:15:31.258385 kernel: efi: SMBIOS=0x9c9ab000 ACPI=0x9cb7e000 ACPI 2.0=0x9cb7e014 MEMATTR=0x9b675198 Nov 1 00:15:31.258395 kernel: SMBIOS 2.8 present. Nov 1 00:15:31.258404 kernel: DMI: QEMU Standard PC (Q35 + ICH9, 2009), BIOS 0.0.0 02/06/2015 Nov 1 00:15:31.258413 kernel: Hypervisor detected: KVM Nov 1 00:15:31.258427 kernel: kvm-clock: Using msrs 4b564d01 and 4b564d00 Nov 1 00:15:31.258437 kernel: kvm-clock: using sched offset of 7678814376 cycles Nov 1 00:15:31.258447 kernel: clocksource: kvm-clock: mask: 0xffffffffffffffff max_cycles: 0x1cd42e4dffb, max_idle_ns: 881590591483 ns Nov 1 00:15:31.258457 kernel: tsc: Detected 2794.750 MHz processor Nov 1 00:15:31.258467 kernel: e820: update [mem 0x00000000-0x00000fff] usable ==> reserved Nov 1 00:15:31.258477 kernel: e820: remove [mem 0x000a0000-0x000fffff] usable Nov 1 00:15:31.258488 kernel: last_pfn = 0x9cf40 max_arch_pfn = 0x400000000 Nov 1 00:15:31.258497 kernel: MTRR map: 4 entries (2 fixed + 2 variable; max 18), built from 8 variable MTRRs Nov 1 00:15:31.258507 kernel: x86/PAT: Configuration [0-7]: WB WC UC- UC WB WP UC- WT Nov 1 00:15:31.258522 kernel: Using GB pages for direct mapping Nov 1 00:15:31.258531 kernel: Secure boot disabled Nov 1 00:15:31.258541 kernel: ACPI: Early table checksum verification disabled Nov 1 00:15:31.258551 kernel: ACPI: RSDP 0x000000009CB7E014 000024 (v02 BOCHS ) Nov 1 00:15:31.258567 kernel: ACPI: XSDT 0x000000009CB7D0E8 000054 (v01 BOCHS BXPC 00000001 01000013) Nov 1 00:15:31.258577 kernel: ACPI: FACP 0x000000009CB79000 0000F4 (v03 BOCHS BXPC 00000001 BXPC 00000001) Nov 1 00:15:31.258587 kernel: ACPI: DSDT 0x000000009CB7A000 0021BA (v01 BOCHS BXPC 00000001 BXPC 00000001) Nov 1 00:15:31.258601 kernel: ACPI: FACS 0x000000009CBDD000 000040 Nov 1 00:15:31.258611 kernel: ACPI: APIC 0x000000009CB78000 000090 (v01 BOCHS BXPC 00000001 BXPC 00000001) Nov 1 00:15:31.258626 kernel: ACPI: HPET 0x000000009CB77000 000038 (v01 BOCHS BXPC 00000001 BXPC 00000001) Nov 1 00:15:31.258636 kernel: ACPI: MCFG 0x000000009CB76000 00003C (v01 BOCHS BXPC 00000001 BXPC 00000001) Nov 1 00:15:31.258646 kernel: ACPI: WAET 0x000000009CB75000 000028 (v01 BOCHS BXPC 00000001 BXPC 00000001) Nov 1 00:15:31.258656 kernel: ACPI: BGRT 0x000000009CB74000 000038 (v01 INTEL EDK2 00000002 01000013) Nov 1 00:15:31.258667 kernel: ACPI: Reserving FACP table memory at [mem 0x9cb79000-0x9cb790f3] Nov 1 00:15:31.258681 kernel: ACPI: Reserving DSDT table memory at [mem 0x9cb7a000-0x9cb7c1b9] Nov 1 00:15:31.258691 kernel: ACPI: Reserving FACS table memory at [mem 0x9cbdd000-0x9cbdd03f] Nov 1 00:15:31.258701 kernel: ACPI: Reserving APIC table memory at [mem 0x9cb78000-0x9cb7808f] Nov 1 00:15:31.258711 kernel: ACPI: Reserving HPET table memory at [mem 0x9cb77000-0x9cb77037] Nov 1 00:15:31.258721 kernel: ACPI: Reserving MCFG table memory at [mem 0x9cb76000-0x9cb7603b] Nov 1 00:15:31.258731 kernel: ACPI: Reserving WAET table memory at [mem 0x9cb75000-0x9cb75027] Nov 1 00:15:31.258759 kernel: ACPI: Reserving BGRT table memory at [mem 0x9cb74000-0x9cb74037] Nov 1 00:15:31.258770 kernel: No NUMA configuration found Nov 1 00:15:31.258784 kernel: Faking a node at [mem 0x0000000000000000-0x000000009cf3ffff] Nov 1 00:15:31.258799 kernel: NODE_DATA(0) allocated [mem 0x9cea6000-0x9ceabfff] Nov 1 00:15:31.258809 kernel: Zone ranges: Nov 1 00:15:31.258820 kernel: DMA [mem 0x0000000000001000-0x0000000000ffffff] Nov 1 00:15:31.258830 kernel: DMA32 [mem 0x0000000001000000-0x000000009cf3ffff] Nov 1 00:15:31.258840 kernel: Normal empty Nov 1 00:15:31.258850 kernel: Movable zone start for each node Nov 1 00:15:31.258860 kernel: Early memory node ranges Nov 1 00:15:31.258870 kernel: node 0: [mem 0x0000000000001000-0x000000000009ffff] Nov 1 00:15:31.258880 kernel: node 0: [mem 0x0000000000100000-0x00000000007fffff] Nov 1 00:15:31.258890 kernel: node 0: [mem 0x0000000000808000-0x000000000080afff] Nov 1 00:15:31.258905 kernel: node 0: [mem 0x000000000080c000-0x000000000080ffff] Nov 1 00:15:31.258924 kernel: node 0: [mem 0x0000000000900000-0x000000009c8eefff] Nov 1 00:15:31.258934 kernel: node 0: [mem 0x000000009cbff000-0x000000009cf3ffff] Nov 1 00:15:31.258948 kernel: Initmem setup node 0 [mem 0x0000000000001000-0x000000009cf3ffff] Nov 1 00:15:31.258958 kernel: On node 0, zone DMA: 1 pages in unavailable ranges Nov 1 00:15:31.258968 kernel: On node 0, zone DMA: 96 pages in unavailable ranges Nov 1 00:15:31.258979 kernel: On node 0, zone DMA: 8 pages in unavailable ranges Nov 1 00:15:31.258989 kernel: On node 0, zone DMA: 1 pages in unavailable ranges Nov 1 00:15:31.258999 kernel: On node 0, zone DMA: 240 pages in unavailable ranges Nov 1 00:15:31.259014 kernel: On node 0, zone DMA32: 784 pages in unavailable ranges Nov 1 00:15:31.259025 kernel: On node 0, zone DMA32: 12480 pages in unavailable ranges Nov 1 00:15:31.259034 kernel: ACPI: PM-Timer IO Port: 0x608 Nov 1 00:15:31.259044 kernel: ACPI: LAPIC_NMI (acpi_id[0xff] dfl dfl lint[0x1]) Nov 1 00:15:31.259054 kernel: IOAPIC[0]: apic_id 0, version 17, address 0xfec00000, GSI 0-23 Nov 1 00:15:31.259064 kernel: ACPI: INT_SRC_OVR (bus 0 bus_irq 0 global_irq 2 dfl dfl) Nov 1 00:15:31.259074 kernel: ACPI: INT_SRC_OVR (bus 0 bus_irq 5 global_irq 5 high level) Nov 1 00:15:31.259085 kernel: ACPI: INT_SRC_OVR (bus 0 bus_irq 9 global_irq 9 high level) Nov 1 00:15:31.259095 kernel: ACPI: INT_SRC_OVR (bus 0 bus_irq 10 global_irq 10 high level) Nov 1 00:15:31.259110 kernel: ACPI: INT_SRC_OVR (bus 0 bus_irq 11 global_irq 11 high level) Nov 1 00:15:31.259120 kernel: ACPI: Using ACPI (MADT) for SMP configuration information Nov 1 00:15:31.259130 kernel: ACPI: HPET id: 0x8086a201 base: 0xfed00000 Nov 1 00:15:31.259140 kernel: TSC deadline timer available Nov 1 00:15:31.259150 kernel: smpboot: Allowing 4 CPUs, 0 hotplug CPUs Nov 1 00:15:31.259160 kernel: kvm-guest: APIC: eoi() replaced with kvm_guest_apic_eoi_write() Nov 1 00:15:31.259170 kernel: kvm-guest: KVM setup pv remote TLB flush Nov 1 00:15:31.259180 kernel: kvm-guest: setup PV sched yield Nov 1 00:15:31.259190 kernel: [mem 0xc0000000-0xffffffff] available for PCI devices Nov 1 00:15:31.259205 kernel: Booting paravirtualized kernel on KVM Nov 1 00:15:31.259215 kernel: clocksource: refined-jiffies: mask: 0xffffffff max_cycles: 0xffffffff, max_idle_ns: 1910969940391419 ns Nov 1 00:15:31.259226 kernel: setup_percpu: NR_CPUS:512 nr_cpumask_bits:4 nr_cpu_ids:4 nr_node_ids:1 Nov 1 00:15:31.259236 kernel: percpu: Embedded 58 pages/cpu s196712 r8192 d32664 u524288 Nov 1 00:15:31.259246 kernel: pcpu-alloc: s196712 r8192 d32664 u524288 alloc=1*2097152 Nov 1 00:15:31.259256 kernel: pcpu-alloc: [0] 0 1 2 3 Nov 1 00:15:31.259266 kernel: kvm-guest: PV spinlocks enabled Nov 1 00:15:31.259276 kernel: PV qspinlock hash table entries: 256 (order: 0, 4096 bytes, linear) Nov 1 00:15:31.259288 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=ade41980c48607de3d2d18dc444731ec5388853e3a75ed2d5a13ce616b36f478 Nov 1 00:15:31.259308 kernel: random: crng init done Nov 1 00:15:31.259318 kernel: Dentry cache hash table entries: 524288 (order: 10, 4194304 bytes, linear) Nov 1 00:15:31.259328 kernel: Inode-cache hash table entries: 262144 (order: 9, 2097152 bytes, linear) Nov 1 00:15:31.259338 kernel: Fallback order for Node 0: 0 Nov 1 00:15:31.259349 kernel: Built 1 zonelists, mobility grouping on. Total pages: 629759 Nov 1 00:15:31.259359 kernel: Policy zone: DMA32 Nov 1 00:15:31.259369 kernel: mem auto-init: stack:off, heap alloc:off, heap free:off Nov 1 00:15:31.259379 kernel: Memory: 2400600K/2567000K available (12288K kernel code, 2288K rwdata, 22748K rodata, 42884K init, 2316K bss, 166140K reserved, 0K cma-reserved) Nov 1 00:15:31.259395 kernel: SLUB: HWalign=64, Order=0-3, MinObjects=0, CPUs=4, Nodes=1 Nov 1 00:15:31.259405 kernel: ftrace: allocating 37980 entries in 149 pages Nov 1 00:15:31.259415 kernel: ftrace: allocated 149 pages with 4 groups Nov 1 00:15:31.259426 kernel: Dynamic Preempt: voluntary Nov 1 00:15:31.259436 kernel: rcu: Preemptible hierarchical RCU implementation. Nov 1 00:15:31.259459 kernel: rcu: RCU event tracing is enabled. Nov 1 00:15:31.259474 kernel: rcu: RCU restricting CPUs from NR_CPUS=512 to nr_cpu_ids=4. Nov 1 00:15:31.259485 kernel: Trampoline variant of Tasks RCU enabled. Nov 1 00:15:31.259496 kernel: Rude variant of Tasks RCU enabled. Nov 1 00:15:31.259507 kernel: Tracing variant of Tasks RCU enabled. Nov 1 00:15:31.259517 kernel: rcu: RCU calculated value of scheduler-enlistment delay is 100 jiffies. Nov 1 00:15:31.259528 kernel: rcu: Adjusting geometry for rcu_fanout_leaf=16, nr_cpu_ids=4 Nov 1 00:15:31.259543 kernel: NR_IRQS: 33024, nr_irqs: 456, preallocated irqs: 16 Nov 1 00:15:31.259554 kernel: rcu: srcu_init: Setting srcu_struct sizes based on contention. Nov 1 00:15:31.259565 kernel: Console: colour dummy device 80x25 Nov 1 00:15:31.259575 kernel: printk: console [ttyS0] enabled Nov 1 00:15:31.259590 kernel: ACPI: Core revision 20230628 Nov 1 00:15:31.259606 kernel: clocksource: hpet: mask: 0xffffffff max_cycles: 0xffffffff, max_idle_ns: 19112604467 ns Nov 1 00:15:31.259616 kernel: APIC: Switch to symmetric I/O mode setup Nov 1 00:15:31.259626 kernel: x2apic enabled Nov 1 00:15:31.259636 kernel: APIC: Switched APIC routing to: physical x2apic Nov 1 00:15:31.259647 kernel: kvm-guest: APIC: send_IPI_mask() replaced with kvm_send_ipi_mask() Nov 1 00:15:31.259657 kernel: kvm-guest: APIC: send_IPI_mask_allbutself() replaced with kvm_send_ipi_mask_allbutself() Nov 1 00:15:31.259667 kernel: kvm-guest: setup PV IPIs Nov 1 00:15:31.259678 kernel: ..TIMER: vector=0x30 apic1=0 pin1=2 apic2=-1 pin2=-1 Nov 1 00:15:31.259688 kernel: tsc: Marking TSC unstable due to TSCs unsynchronized Nov 1 00:15:31.259704 kernel: Calibrating delay loop (skipped) preset value.. 5589.50 BogoMIPS (lpj=2794750) Nov 1 00:15:31.259714 kernel: x86/cpu: User Mode Instruction Prevention (UMIP) activated Nov 1 00:15:31.259725 kernel: Last level iTLB entries: 4KB 512, 2MB 255, 4MB 127 Nov 1 00:15:31.259735 kernel: Last level dTLB entries: 4KB 512, 2MB 255, 4MB 127, 1GB 0 Nov 1 00:15:31.259765 kernel: Spectre V1 : Mitigation: usercopy/swapgs barriers and __user pointer sanitization Nov 1 00:15:31.259776 kernel: Spectre V2 : Mitigation: Retpolines Nov 1 00:15:31.259787 kernel: Spectre V2 : Spectre v2 / SpectreRSB: Filling RSB on context switch and VMEXIT Nov 1 00:15:31.259798 kernel: Spectre V2 : Enabling Speculation Barrier for firmware calls Nov 1 00:15:31.259809 kernel: active return thunk: retbleed_return_thunk Nov 1 00:15:31.259825 kernel: RETBleed: Mitigation: untrained return thunk Nov 1 00:15:31.259836 kernel: Spectre V2 : mitigation: Enabling conditional Indirect Branch Prediction Barrier Nov 1 00:15:31.259847 kernel: Speculative Store Bypass: Mitigation: Speculative Store Bypass disabled via prctl Nov 1 00:15:31.259858 kernel: Speculative Return Stack Overflow: IBPB-extending microcode not applied! Nov 1 00:15:31.259874 kernel: Speculative Return Stack Overflow: WARNING: See https://kernel.org/doc/html/latest/admin-guide/hw-vuln/srso.html for mitigation options. Nov 1 00:15:31.259885 kernel: active return thunk: srso_return_thunk Nov 1 00:15:31.259896 kernel: Speculative Return Stack Overflow: Vulnerable: Safe RET, no microcode Nov 1 00:15:31.259907 kernel: x86/fpu: Supporting XSAVE feature 0x001: 'x87 floating point registers' Nov 1 00:15:31.259932 kernel: x86/fpu: Supporting XSAVE feature 0x002: 'SSE registers' Nov 1 00:15:31.259943 kernel: x86/fpu: Supporting XSAVE feature 0x004: 'AVX registers' Nov 1 00:15:31.259954 kernel: x86/fpu: xstate_offset[2]: 576, xstate_sizes[2]: 256 Nov 1 00:15:31.259965 kernel: x86/fpu: Enabled xstate features 0x7, context size is 832 bytes, using 'compacted' format. Nov 1 00:15:31.259975 kernel: Freeing SMP alternatives memory: 32K Nov 1 00:15:31.259986 kernel: pid_max: default: 32768 minimum: 301 Nov 1 00:15:31.259996 kernel: LSM: initializing lsm=lockdown,capability,landlock,selinux,integrity Nov 1 00:15:31.260007 kernel: landlock: Up and running. Nov 1 00:15:31.260018 kernel: SELinux: Initializing. Nov 1 00:15:31.260034 kernel: Mount-cache hash table entries: 8192 (order: 4, 65536 bytes, linear) Nov 1 00:15:31.260045 kernel: Mountpoint-cache hash table entries: 8192 (order: 4, 65536 bytes, linear) Nov 1 00:15:31.260056 kernel: smpboot: CPU0: AMD EPYC 7402P 24-Core Processor (family: 0x17, model: 0x31, stepping: 0x0) Nov 1 00:15:31.260067 kernel: RCU Tasks: Setting shift to 2 and lim to 1 rcu_task_cb_adjust=1 rcu_task_cpu_ids=4. Nov 1 00:15:31.260078 kernel: RCU Tasks Rude: Setting shift to 2 and lim to 1 rcu_task_cb_adjust=1 rcu_task_cpu_ids=4. Nov 1 00:15:31.260089 kernel: RCU Tasks Trace: Setting shift to 2 and lim to 1 rcu_task_cb_adjust=1 rcu_task_cpu_ids=4. Nov 1 00:15:31.260100 kernel: Performance Events: Fam17h+ core perfctr, AMD PMU driver. Nov 1 00:15:31.260110 kernel: ... version: 0 Nov 1 00:15:31.260121 kernel: ... bit width: 48 Nov 1 00:15:31.260136 kernel: ... generic registers: 6 Nov 1 00:15:31.260147 kernel: ... value mask: 0000ffffffffffff Nov 1 00:15:31.260157 kernel: ... max period: 00007fffffffffff Nov 1 00:15:31.260168 kernel: ... fixed-purpose events: 0 Nov 1 00:15:31.260179 kernel: ... event mask: 000000000000003f Nov 1 00:15:31.260189 kernel: signal: max sigframe size: 1776 Nov 1 00:15:31.260200 kernel: rcu: Hierarchical SRCU implementation. Nov 1 00:15:31.260211 kernel: rcu: Max phase no-delay instances is 400. Nov 1 00:15:31.260222 kernel: smp: Bringing up secondary CPUs ... Nov 1 00:15:31.260237 kernel: smpboot: x86: Booting SMP configuration: Nov 1 00:15:31.260248 kernel: .... node #0, CPUs: #1 #2 #3 Nov 1 00:15:31.260259 kernel: smp: Brought up 1 node, 4 CPUs Nov 1 00:15:31.260269 kernel: smpboot: Max logical packages: 1 Nov 1 00:15:31.260280 kernel: smpboot: Total of 4 processors activated (22358.00 BogoMIPS) Nov 1 00:15:31.260291 kernel: devtmpfs: initialized Nov 1 00:15:31.260302 kernel: x86/mm: Memory block size: 128MB Nov 1 00:15:31.260313 kernel: ACPI: PM: Registering ACPI NVS region [mem 0x00800000-0x00807fff] (32768 bytes) Nov 1 00:15:31.260323 kernel: ACPI: PM: Registering ACPI NVS region [mem 0x0080b000-0x0080bfff] (4096 bytes) Nov 1 00:15:31.260339 kernel: ACPI: PM: Registering ACPI NVS region [mem 0x00810000-0x008fffff] (983040 bytes) Nov 1 00:15:31.260349 kernel: ACPI: PM: Registering ACPI NVS region [mem 0x9cb7f000-0x9cbfefff] (524288 bytes) Nov 1 00:15:31.260360 kernel: ACPI: PM: Registering ACPI NVS region [mem 0x9cf60000-0x9cffffff] (655360 bytes) Nov 1 00:15:31.260371 kernel: clocksource: jiffies: mask: 0xffffffff max_cycles: 0xffffffff, max_idle_ns: 1911260446275000 ns Nov 1 00:15:31.260382 kernel: futex hash table entries: 1024 (order: 4, 65536 bytes, linear) Nov 1 00:15:31.260393 kernel: pinctrl core: initialized pinctrl subsystem Nov 1 00:15:31.260404 kernel: NET: Registered PF_NETLINK/PF_ROUTE protocol family Nov 1 00:15:31.260414 kernel: audit: initializing netlink subsys (disabled) Nov 1 00:15:31.260425 kernel: audit: type=2000 audit(1761956128.906:1): state=initialized audit_enabled=0 res=1 Nov 1 00:15:31.260441 kernel: thermal_sys: Registered thermal governor 'step_wise' Nov 1 00:15:31.260451 kernel: thermal_sys: Registered thermal governor 'user_space' Nov 1 00:15:31.260461 kernel: cpuidle: using governor menu Nov 1 00:15:31.260472 kernel: acpiphp: ACPI Hot Plug PCI Controller Driver version: 0.5 Nov 1 00:15:31.260483 kernel: dca service started, version 1.12.1 Nov 1 00:15:31.260493 kernel: PCI: MMCONFIG for domain 0000 [bus 00-ff] at [mem 0xb0000000-0xbfffffff] (base 0xb0000000) Nov 1 00:15:31.260504 kernel: PCI: MMCONFIG at [mem 0xb0000000-0xbfffffff] reserved as E820 entry Nov 1 00:15:31.260515 kernel: PCI: Using configuration type 1 for base access Nov 1 00:15:31.260526 kernel: kprobes: kprobe jump-optimization is enabled. All kprobes are optimized if possible. Nov 1 00:15:31.260542 kernel: HugeTLB: registered 1.00 GiB page size, pre-allocated 0 pages Nov 1 00:15:31.260553 kernel: HugeTLB: 16380 KiB vmemmap can be freed for a 1.00 GiB page Nov 1 00:15:31.260564 kernel: HugeTLB: registered 2.00 MiB page size, pre-allocated 0 pages Nov 1 00:15:31.260574 kernel: HugeTLB: 28 KiB vmemmap can be freed for a 2.00 MiB page Nov 1 00:15:31.260585 kernel: ACPI: Added _OSI(Module Device) Nov 1 00:15:31.260595 kernel: ACPI: Added _OSI(Processor Device) Nov 1 00:15:31.260606 kernel: ACPI: Added _OSI(Processor Aggregator Device) Nov 1 00:15:31.260617 kernel: ACPI: 1 ACPI AML tables successfully acquired and loaded Nov 1 00:15:31.260628 kernel: ACPI: _OSC evaluation for CPUs failed, trying _PDC Nov 1 00:15:31.260644 kernel: ACPI: Interpreter enabled Nov 1 00:15:31.260654 kernel: ACPI: PM: (supports S0 S3 S5) Nov 1 00:15:31.260665 kernel: ACPI: Using IOAPIC for interrupt routing Nov 1 00:15:31.260675 kernel: PCI: Using host bridge windows from ACPI; if necessary, use "pci=nocrs" and report a bug Nov 1 00:15:31.260686 kernel: PCI: Using E820 reservations for host bridge windows Nov 1 00:15:31.260697 kernel: ACPI: Enabled 2 GPEs in block 00 to 3F Nov 1 00:15:31.260707 kernel: ACPI: PCI Root Bridge [PCI0] (domain 0000 [bus 00-ff]) Nov 1 00:15:31.261033 kernel: acpi PNP0A08:00: _OSC: OS supports [ExtendedConfig ASPM ClockPM Segments MSI HPX-Type3] Nov 1 00:15:31.261241 kernel: acpi PNP0A08:00: _OSC: platform does not support [PCIeHotplug LTR] Nov 1 00:15:31.261425 kernel: acpi PNP0A08:00: _OSC: OS now controls [PME AER PCIeCapability] Nov 1 00:15:31.261441 kernel: PCI host bridge to bus 0000:00 Nov 1 00:15:31.261648 kernel: pci_bus 0000:00: root bus resource [io 0x0000-0x0cf7 window] Nov 1 00:15:31.261840 kernel: pci_bus 0000:00: root bus resource [io 0x0d00-0xffff window] Nov 1 00:15:31.262019 kernel: pci_bus 0000:00: root bus resource [mem 0x000a0000-0x000bffff window] Nov 1 00:15:31.262186 kernel: pci_bus 0000:00: root bus resource [mem 0x9d000000-0xafffffff window] Nov 1 00:15:31.262359 kernel: pci_bus 0000:00: root bus resource [mem 0xc0000000-0xfebfffff window] Nov 1 00:15:31.262525 kernel: pci_bus 0000:00: root bus resource [mem 0x800000000-0xfffffffff window] Nov 1 00:15:31.262690 kernel: pci_bus 0000:00: root bus resource [bus 00-ff] Nov 1 00:15:31.262942 kernel: pci 0000:00:00.0: [8086:29c0] type 00 class 0x060000 Nov 1 00:15:31.263159 kernel: pci 0000:00:01.0: [1234:1111] type 00 class 0x030000 Nov 1 00:15:31.263342 kernel: pci 0000:00:01.0: reg 0x10: [mem 0xc0000000-0xc0ffffff pref] Nov 1 00:15:31.263530 kernel: pci 0000:00:01.0: reg 0x18: [mem 0xc1044000-0xc1044fff] Nov 1 00:15:31.263711 kernel: pci 0000:00:01.0: reg 0x30: [mem 0xffff0000-0xffffffff pref] Nov 1 00:15:31.263924 kernel: pci 0000:00:01.0: BAR 0: assigned to efifb Nov 1 00:15:31.264109 kernel: pci 0000:00:01.0: Video device with shadowed ROM at [mem 0x000c0000-0x000dffff] Nov 1 00:15:31.264317 kernel: pci 0000:00:02.0: [1af4:1005] type 00 class 0x00ff00 Nov 1 00:15:31.264499 kernel: pci 0000:00:02.0: reg 0x10: [io 0x6100-0x611f] Nov 1 00:15:31.264679 kernel: pci 0000:00:02.0: reg 0x14: [mem 0xc1043000-0xc1043fff] Nov 1 00:15:31.264890 kernel: pci 0000:00:02.0: reg 0x20: [mem 0x800000000-0x800003fff 64bit pref] Nov 1 00:15:31.265104 kernel: pci 0000:00:03.0: [1af4:1001] type 00 class 0x010000 Nov 1 00:15:31.265287 kernel: pci 0000:00:03.0: reg 0x10: [io 0x6000-0x607f] Nov 1 00:15:31.265484 kernel: pci 0000:00:03.0: reg 0x14: [mem 0xc1042000-0xc1042fff] Nov 1 00:15:31.265649 kernel: pci 0000:00:03.0: reg 0x20: [mem 0x800004000-0x800007fff 64bit pref] Nov 1 00:15:31.265879 kernel: pci 0000:00:04.0: [1af4:1000] type 00 class 0x020000 Nov 1 00:15:31.266094 kernel: pci 0000:00:04.0: reg 0x10: [io 0x60e0-0x60ff] Nov 1 00:15:31.266245 kernel: pci 0000:00:04.0: reg 0x14: [mem 0xc1041000-0xc1041fff] Nov 1 00:15:31.266379 kernel: pci 0000:00:04.0: reg 0x20: [mem 0x800008000-0x80000bfff 64bit pref] Nov 1 00:15:31.266509 kernel: pci 0000:00:04.0: reg 0x30: [mem 0xfffc0000-0xffffffff pref] Nov 1 00:15:31.266664 kernel: pci 0000:00:1f.0: [8086:2918] type 00 class 0x060100 Nov 1 00:15:31.266817 kernel: pci 0000:00:1f.0: quirk: [io 0x0600-0x067f] claimed by ICH6 ACPI/GPIO/TCO Nov 1 00:15:31.266977 kernel: pci 0000:00:1f.2: [8086:2922] type 00 class 0x010601 Nov 1 00:15:31.267115 kernel: pci 0000:00:1f.2: reg 0x20: [io 0x60c0-0x60df] Nov 1 00:15:31.267244 kernel: pci 0000:00:1f.2: reg 0x24: [mem 0xc1040000-0xc1040fff] Nov 1 00:15:31.267430 kernel: pci 0000:00:1f.3: [8086:2930] type 00 class 0x0c0500 Nov 1 00:15:31.267561 kernel: pci 0000:00:1f.3: reg 0x20: [io 0x6080-0x60bf] Nov 1 00:15:31.267572 kernel: ACPI: PCI: Interrupt link LNKA configured for IRQ 10 Nov 1 00:15:31.267580 kernel: ACPI: PCI: Interrupt link LNKB configured for IRQ 10 Nov 1 00:15:31.267588 kernel: ACPI: PCI: Interrupt link LNKC configured for IRQ 11 Nov 1 00:15:31.267596 kernel: ACPI: PCI: Interrupt link LNKD configured for IRQ 11 Nov 1 00:15:31.267608 kernel: ACPI: PCI: Interrupt link LNKE configured for IRQ 10 Nov 1 00:15:31.267616 kernel: ACPI: PCI: Interrupt link LNKF configured for IRQ 10 Nov 1 00:15:31.267623 kernel: ACPI: PCI: Interrupt link LNKG configured for IRQ 11 Nov 1 00:15:31.267631 kernel: ACPI: PCI: Interrupt link LNKH configured for IRQ 11 Nov 1 00:15:31.267638 kernel: ACPI: PCI: Interrupt link GSIA configured for IRQ 16 Nov 1 00:15:31.267646 kernel: ACPI: PCI: Interrupt link GSIB configured for IRQ 17 Nov 1 00:15:31.267653 kernel: ACPI: PCI: Interrupt link GSIC configured for IRQ 18 Nov 1 00:15:31.267661 kernel: ACPI: PCI: Interrupt link GSID configured for IRQ 19 Nov 1 00:15:31.267669 kernel: ACPI: PCI: Interrupt link GSIE configured for IRQ 20 Nov 1 00:15:31.267679 kernel: ACPI: PCI: Interrupt link GSIF configured for IRQ 21 Nov 1 00:15:31.267686 kernel: ACPI: PCI: Interrupt link GSIG configured for IRQ 22 Nov 1 00:15:31.267694 kernel: ACPI: PCI: Interrupt link GSIH configured for IRQ 23 Nov 1 00:15:31.267702 kernel: iommu: Default domain type: Translated Nov 1 00:15:31.267709 kernel: iommu: DMA domain TLB invalidation policy: lazy mode Nov 1 00:15:31.267717 kernel: efivars: Registered efivars operations Nov 1 00:15:31.267724 kernel: PCI: Using ACPI for IRQ routing Nov 1 00:15:31.267732 kernel: PCI: pci_cache_line_size set to 64 bytes Nov 1 00:15:31.267739 kernel: e820: reserve RAM buffer [mem 0x0080b000-0x008fffff] Nov 1 00:15:31.267765 kernel: e820: reserve RAM buffer [mem 0x00810000-0x008fffff] Nov 1 00:15:31.267772 kernel: e820: reserve RAM buffer [mem 0x9c8ef000-0x9fffffff] Nov 1 00:15:31.267780 kernel: e820: reserve RAM buffer [mem 0x9cf40000-0x9fffffff] Nov 1 00:15:31.267926 kernel: pci 0000:00:01.0: vgaarb: setting as boot VGA device Nov 1 00:15:31.268068 kernel: pci 0000:00:01.0: vgaarb: bridge control possible Nov 1 00:15:31.268198 kernel: pci 0000:00:01.0: vgaarb: VGA device added: decodes=io+mem,owns=io+mem,locks=none Nov 1 00:15:31.268209 kernel: vgaarb: loaded Nov 1 00:15:31.268217 kernel: hpet0: at MMIO 0xfed00000, IRQs 2, 8, 0 Nov 1 00:15:31.268224 kernel: hpet0: 3 comparators, 64-bit 100.000000 MHz counter Nov 1 00:15:31.268237 kernel: clocksource: Switched to clocksource kvm-clock Nov 1 00:15:31.268244 kernel: VFS: Disk quotas dquot_6.6.0 Nov 1 00:15:31.268252 kernel: VFS: Dquot-cache hash table entries: 512 (order 0, 4096 bytes) Nov 1 00:15:31.268260 kernel: pnp: PnP ACPI init Nov 1 00:15:31.268420 kernel: system 00:05: [mem 0xb0000000-0xbfffffff window] has been reserved Nov 1 00:15:31.268433 kernel: pnp: PnP ACPI: found 6 devices Nov 1 00:15:31.268440 kernel: clocksource: acpi_pm: mask: 0xffffff max_cycles: 0xffffff, max_idle_ns: 2085701024 ns Nov 1 00:15:31.268448 kernel: NET: Registered PF_INET protocol family Nov 1 00:15:31.268460 kernel: IP idents hash table entries: 65536 (order: 7, 524288 bytes, linear) Nov 1 00:15:31.268468 kernel: tcp_listen_portaddr_hash hash table entries: 2048 (order: 3, 32768 bytes, linear) Nov 1 00:15:31.268475 kernel: Table-perturb hash table entries: 65536 (order: 6, 262144 bytes, linear) Nov 1 00:15:31.268483 kernel: TCP established hash table entries: 32768 (order: 6, 262144 bytes, linear) Nov 1 00:15:31.268491 kernel: TCP bind hash table entries: 32768 (order: 8, 1048576 bytes, linear) Nov 1 00:15:31.268499 kernel: TCP: Hash tables configured (established 32768 bind 32768) Nov 1 00:15:31.268506 kernel: UDP hash table entries: 2048 (order: 4, 65536 bytes, linear) Nov 1 00:15:31.268514 kernel: UDP-Lite hash table entries: 2048 (order: 4, 65536 bytes, linear) Nov 1 00:15:31.268522 kernel: NET: Registered PF_UNIX/PF_LOCAL protocol family Nov 1 00:15:31.268532 kernel: NET: Registered PF_XDP protocol family Nov 1 00:15:31.268665 kernel: pci 0000:00:04.0: can't claim BAR 6 [mem 0xfffc0000-0xffffffff pref]: no compatible bridge window Nov 1 00:15:31.268813 kernel: pci 0000:00:04.0: BAR 6: assigned [mem 0x9d000000-0x9d03ffff pref] Nov 1 00:15:31.268945 kernel: pci_bus 0000:00: resource 4 [io 0x0000-0x0cf7 window] Nov 1 00:15:31.269065 kernel: pci_bus 0000:00: resource 5 [io 0x0d00-0xffff window] Nov 1 00:15:31.269183 kernel: pci_bus 0000:00: resource 6 [mem 0x000a0000-0x000bffff window] Nov 1 00:15:31.269442 kernel: pci_bus 0000:00: resource 7 [mem 0x9d000000-0xafffffff window] Nov 1 00:15:31.269564 kernel: pci_bus 0000:00: resource 8 [mem 0xc0000000-0xfebfffff window] Nov 1 00:15:31.269698 kernel: pci_bus 0000:00: resource 9 [mem 0x800000000-0xfffffffff window] Nov 1 00:15:31.269709 kernel: PCI: CLS 0 bytes, default 64 Nov 1 00:15:31.269717 kernel: Initialise system trusted keyrings Nov 1 00:15:31.269725 kernel: workingset: timestamp_bits=39 max_order=20 bucket_order=0 Nov 1 00:15:31.269732 kernel: Key type asymmetric registered Nov 1 00:15:31.269756 kernel: Asymmetric key parser 'x509' registered Nov 1 00:15:31.269764 kernel: Block layer SCSI generic (bsg) driver version 0.4 loaded (major 251) Nov 1 00:15:31.269772 kernel: io scheduler mq-deadline registered Nov 1 00:15:31.269784 kernel: io scheduler kyber registered Nov 1 00:15:31.269791 kernel: io scheduler bfq registered Nov 1 00:15:31.269799 kernel: ioatdma: Intel(R) QuickData Technology Driver 5.00 Nov 1 00:15:31.269807 kernel: ACPI: \_SB_.GSIG: Enabled at IRQ 22 Nov 1 00:15:31.269815 kernel: ACPI: \_SB_.GSIH: Enabled at IRQ 23 Nov 1 00:15:31.269823 kernel: ACPI: \_SB_.GSIE: Enabled at IRQ 20 Nov 1 00:15:31.269831 kernel: Serial: 8250/16550 driver, 4 ports, IRQ sharing enabled Nov 1 00:15:31.269838 kernel: 00:03: ttyS0 at I/O 0x3f8 (irq = 4, base_baud = 115200) is a 16550A Nov 1 00:15:31.269846 kernel: i8042: PNP: PS/2 Controller [PNP0303:KBD,PNP0f13:MOU] at 0x60,0x64 irq 1,12 Nov 1 00:15:31.269854 kernel: serio: i8042 KBD port at 0x60,0x64 irq 1 Nov 1 00:15:31.269864 kernel: serio: i8042 AUX port at 0x60,0x64 irq 12 Nov 1 00:15:31.269872 kernel: input: AT Translated Set 2 keyboard as /devices/platform/i8042/serio0/input/input0 Nov 1 00:15:31.270034 kernel: rtc_cmos 00:04: RTC can wake from S4 Nov 1 00:15:31.270160 kernel: rtc_cmos 00:04: registered as rtc0 Nov 1 00:15:31.270283 kernel: rtc_cmos 00:04: setting system clock to 2025-11-01T00:15:30 UTC (1761956130) Nov 1 00:15:31.270404 kernel: rtc_cmos 00:04: alarms up to one day, y3k, 242 bytes nvram, hpet irqs Nov 1 00:15:31.270414 kernel: amd_pstate: the _CPC object is not present in SBIOS or ACPI disabled Nov 1 00:15:31.270426 kernel: efifb: probing for efifb Nov 1 00:15:31.270434 kernel: efifb: framebuffer at 0xc0000000, using 1408k, total 1408k Nov 1 00:15:31.270442 kernel: efifb: mode is 800x600x24, linelength=2400, pages=1 Nov 1 00:15:31.270449 kernel: efifb: scrolling: redraw Nov 1 00:15:31.270457 kernel: efifb: Truecolor: size=0:8:8:8, shift=0:16:8:0 Nov 1 00:15:31.270465 kernel: Console: switching to colour frame buffer device 100x37 Nov 1 00:15:31.270473 kernel: fb0: EFI VGA frame buffer device Nov 1 00:15:31.270499 kernel: pstore: Using crash dump compression: deflate Nov 1 00:15:31.270510 kernel: pstore: Registered efi_pstore as persistent store backend Nov 1 00:15:31.270521 kernel: NET: Registered PF_INET6 protocol family Nov 1 00:15:31.270529 kernel: Segment Routing with IPv6 Nov 1 00:15:31.270537 kernel: In-situ OAM (IOAM) with IPv6 Nov 1 00:15:31.270545 kernel: NET: Registered PF_PACKET protocol family Nov 1 00:15:31.270553 kernel: Key type dns_resolver registered Nov 1 00:15:31.270561 kernel: IPI shorthand broadcast: enabled Nov 1 00:15:31.270569 kernel: sched_clock: Marking stable (1221003341, 692345818)->(2515099050, -601749891) Nov 1 00:15:31.270577 kernel: registered taskstats version 1 Nov 1 00:15:31.270585 kernel: Loading compiled-in X.509 certificates Nov 1 00:15:31.270593 kernel: Loaded X.509 cert 'Kinvolk GmbH: Module signing key for 6.6.113-flatcar: cc4975b6f5d9e3149f7a95c8552b8f9120c3a1f4' Nov 1 00:15:31.270604 kernel: Key type .fscrypt registered Nov 1 00:15:31.270612 kernel: Key type fscrypt-provisioning registered Nov 1 00:15:31.270620 kernel: ima: No TPM chip found, activating TPM-bypass! Nov 1 00:15:31.270628 kernel: ima: Allocated hash algorithm: sha1 Nov 1 00:15:31.270636 kernel: ima: No architecture policies found Nov 1 00:15:31.270644 kernel: clk: Disabling unused clocks Nov 1 00:15:31.270651 kernel: Freeing unused kernel image (initmem) memory: 42884K Nov 1 00:15:31.270659 kernel: Write protecting the kernel read-only data: 36864k Nov 1 00:15:31.270667 kernel: Freeing unused kernel image (rodata/data gap) memory: 1828K Nov 1 00:15:31.270678 kernel: Run /init as init process Nov 1 00:15:31.270686 kernel: with arguments: Nov 1 00:15:31.270694 kernel: /init Nov 1 00:15:31.270702 kernel: with environment: Nov 1 00:15:31.270710 kernel: HOME=/ Nov 1 00:15:31.270717 kernel: TERM=linux Nov 1 00:15:31.270728 systemd[1]: systemd 255 running in system mode (+PAM +AUDIT +SELINUX -APPARMOR +IMA +SMACK +SECCOMP +GCRYPT -GNUTLS +OPENSSL -ACL +BLKID +CURL +ELFUTILS -FIDO2 +IDN2 -IDN +IPTC +KMOD +LIBCRYPTSETUP +LIBFDISK +PCRE2 -PWQUALITY -P11KIT -QRENCODE +TPM2 +BZIP2 +LZ4 +XZ +ZLIB +ZSTD -BPF_FRAMEWORK -XKBCOMMON +UTMP -SYSVINIT default-hierarchy=unified) Nov 1 00:15:31.270741 systemd[1]: Detected virtualization kvm. Nov 1 00:15:31.270765 systemd[1]: Detected architecture x86-64. Nov 1 00:15:31.270774 systemd[1]: Running in initrd. Nov 1 00:15:31.270785 systemd[1]: No hostname configured, using default hostname. Nov 1 00:15:31.270794 systemd[1]: Hostname set to . Nov 1 00:15:31.270805 systemd[1]: Initializing machine ID from VM UUID. Nov 1 00:15:31.270814 systemd[1]: Queued start job for default target initrd.target. Nov 1 00:15:31.270822 systemd[1]: Started clevis-luks-askpass.path - Forward Password Requests to Clevis Directory Watch. Nov 1 00:15:31.270831 systemd[1]: Started systemd-ask-password-console.path - Dispatch Password Requests to Console Directory Watch. Nov 1 00:15:31.270840 systemd[1]: Expecting device dev-disk-by\x2dlabel-EFI\x2dSYSTEM.device - /dev/disk/by-label/EFI-SYSTEM... Nov 1 00:15:31.270848 systemd[1]: Expecting device dev-disk-by\x2dlabel-OEM.device - /dev/disk/by-label/OEM... Nov 1 00:15:31.270857 systemd[1]: Expecting device dev-disk-by\x2dlabel-ROOT.device - /dev/disk/by-label/ROOT... Nov 1 00:15:31.270866 systemd[1]: Expecting device dev-disk-by\x2dpartlabel-USR\x2dA.device - /dev/disk/by-partlabel/USR-A... Nov 1 00:15:31.270879 systemd[1]: Expecting device dev-disk-by\x2dpartuuid-7130c94a\x2d213a\x2d4e5a\x2d8e26\x2d6cce9662f132.device - /dev/disk/by-partuuid/7130c94a-213a-4e5a-8e26-6cce9662f132... Nov 1 00:15:31.270888 systemd[1]: Expecting device dev-mapper-usr.device - /dev/mapper/usr... Nov 1 00:15:31.270897 systemd[1]: Reached target cryptsetup-pre.target - Local Encrypted Volumes (Pre). Nov 1 00:15:31.270905 systemd[1]: Reached target cryptsetup.target - Local Encrypted Volumes. Nov 1 00:15:31.270921 systemd[1]: Reached target paths.target - Path Units. Nov 1 00:15:31.270930 systemd[1]: Reached target slices.target - Slice Units. Nov 1 00:15:31.270938 systemd[1]: Reached target swap.target - Swaps. Nov 1 00:15:31.270950 systemd[1]: Reached target timers.target - Timer Units. Nov 1 00:15:31.270959 systemd[1]: Listening on iscsid.socket - Open-iSCSI iscsid Socket. Nov 1 00:15:31.270968 systemd[1]: Listening on iscsiuio.socket - Open-iSCSI iscsiuio Socket. Nov 1 00:15:31.270976 systemd[1]: Listening on systemd-journald-dev-log.socket - Journal Socket (/dev/log). Nov 1 00:15:31.270985 systemd[1]: Listening on systemd-journald.socket - Journal Socket. Nov 1 00:15:31.270993 systemd[1]: Listening on systemd-networkd.socket - Network Service Netlink Socket. Nov 1 00:15:31.271001 systemd[1]: Listening on systemd-udevd-control.socket - udev Control Socket. Nov 1 00:15:31.271010 systemd[1]: Listening on systemd-udevd-kernel.socket - udev Kernel Socket. Nov 1 00:15:31.271018 systemd[1]: Reached target sockets.target - Socket Units. Nov 1 00:15:31.271030 systemd[1]: Starting ignition-setup-pre.service - Ignition env setup... Nov 1 00:15:31.271039 systemd[1]: Starting kmod-static-nodes.service - Create List of Static Device Nodes... Nov 1 00:15:31.271047 systemd[1]: Finished network-cleanup.service - Network Cleanup. Nov 1 00:15:31.271056 systemd[1]: Starting systemd-fsck-usr.service... Nov 1 00:15:31.271064 systemd[1]: Starting systemd-journald.service - Journal Service... Nov 1 00:15:31.271072 systemd[1]: Starting systemd-modules-load.service - Load Kernel Modules... Nov 1 00:15:31.271081 systemd[1]: Starting systemd-vconsole-setup.service - Virtual Console Setup... Nov 1 00:15:31.271089 systemd[1]: Finished ignition-setup-pre.service - Ignition env setup. Nov 1 00:15:31.271101 systemd[1]: Finished kmod-static-nodes.service - Create List of Static Device Nodes. Nov 1 00:15:31.271109 systemd[1]: Finished systemd-fsck-usr.service. Nov 1 00:15:31.271138 systemd-journald[194]: Collecting audit messages is disabled. Nov 1 00:15:31.271160 systemd[1]: Starting systemd-tmpfiles-setup-dev-early.service - Create Static Device Nodes in /dev gracefully... Nov 1 00:15:31.271172 systemd-journald[194]: Journal started Nov 1 00:15:31.271192 systemd-journald[194]: Runtime Journal (/run/log/journal/3778bbf071154c609150fbd9b9f65496) is 6.0M, max 48.3M, 42.2M free. Nov 1 00:15:31.299370 systemd-modules-load[195]: Inserted module 'overlay' Nov 1 00:15:31.334962 systemd[1]: Finished systemd-tmpfiles-setup-dev-early.service - Create Static Device Nodes in /dev gracefully. Nov 1 00:15:31.338623 systemd[1]: Started systemd-journald.service - Journal Service. Nov 1 00:15:31.342475 systemd[1]: Finished systemd-vconsole-setup.service - Virtual Console Setup. Nov 1 00:15:31.353898 systemd[1]: Starting dracut-cmdline-ask.service - dracut ask for additional cmdline parameters... Nov 1 00:15:31.358185 systemd[1]: Starting systemd-tmpfiles-setup-dev.service - Create Static Device Nodes in /dev... Nov 1 00:15:31.361394 systemd[1]: Starting systemd-tmpfiles-setup.service - Create System Files and Directories... Nov 1 00:15:31.377021 kernel: bridge: filtering via arp/ip/ip6tables is no longer available by default. Update your scripts to load br_netfilter if you need this. Nov 1 00:15:31.382082 systemd[1]: Finished systemd-tmpfiles-setup.service - Create System Files and Directories. Nov 1 00:15:31.412845 kernel: Bridge firewalling registered Nov 1 00:15:31.408523 systemd-modules-load[195]: Inserted module 'br_netfilter' Nov 1 00:15:31.409177 systemd[1]: Finished dracut-cmdline-ask.service - dracut ask for additional cmdline parameters. Nov 1 00:15:31.415205 systemd[1]: Finished systemd-tmpfiles-setup-dev.service - Create Static Device Nodes in /dev. Nov 1 00:15:31.429047 systemd[1]: Starting dracut-cmdline.service - dracut cmdline hook... Nov 1 00:15:31.432975 systemd[1]: Finished systemd-modules-load.service - Load Kernel Modules. Nov 1 00:15:31.438701 systemd[1]: Starting systemd-sysctl.service - Apply Kernel Variables... Nov 1 00:15:31.447834 dracut-cmdline[223]: dracut-dracut-053 Nov 1 00:15:31.483061 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=ade41980c48607de3d2d18dc444731ec5388853e3a75ed2d5a13ce616b36f478 Nov 1 00:15:31.455348 systemd[1]: Finished systemd-sysctl.service - Apply Kernel Variables. Nov 1 00:15:31.485333 systemd[1]: Starting systemd-resolved.service - Network Name Resolution... Nov 1 00:15:31.568874 systemd-resolved[263]: Positive Trust Anchors: Nov 1 00:15:31.573329 kernel: SCSI subsystem initialized Nov 1 00:15:31.568891 systemd-resolved[263]: . IN DS 20326 8 2 e06d44b80b8f1d39a95c0b0d7c65d08458e880409bbc683457104237c7f8ec8d Nov 1 00:15:31.568932 systemd-resolved[263]: Negative trust anchors: home.arpa 10.in-addr.arpa 16.172.in-addr.arpa 17.172.in-addr.arpa 18.172.in-addr.arpa 19.172.in-addr.arpa 20.172.in-addr.arpa 21.172.in-addr.arpa 22.172.in-addr.arpa 23.172.in-addr.arpa 24.172.in-addr.arpa 25.172.in-addr.arpa 26.172.in-addr.arpa 27.172.in-addr.arpa 28.172.in-addr.arpa 29.172.in-addr.arpa 30.172.in-addr.arpa 31.172.in-addr.arpa 170.0.0.192.in-addr.arpa 171.0.0.192.in-addr.arpa 168.192.in-addr.arpa d.f.ip6.arpa ipv4only.arpa resolver.arpa corp home internal intranet lan local private test Nov 1 00:15:31.571994 systemd-resolved[263]: Defaulting to hostname 'linux'. Nov 1 00:15:31.575765 systemd[1]: Started systemd-resolved.service - Network Name Resolution. Nov 1 00:15:31.628941 kernel: Loading iSCSI transport class v2.0-870. Nov 1 00:15:31.628912 systemd[1]: Reached target nss-lookup.target - Host and Network Name Lookups. Nov 1 00:15:31.673768 kernel: iscsi: registered transport (tcp) Nov 1 00:15:31.718100 kernel: iscsi: registered transport (qla4xxx) Nov 1 00:15:31.718193 kernel: QLogic iSCSI HBA Driver Nov 1 00:15:31.792592 systemd[1]: Finished dracut-cmdline.service - dracut cmdline hook. Nov 1 00:15:31.830897 systemd[1]: Starting dracut-pre-udev.service - dracut pre-udev hook... Nov 1 00:15:31.891043 kernel: device-mapper: core: CONFIG_IMA_DISABLE_HTABLE is disabled. Duplicate IMA measurements will not be recorded in the IMA log. Nov 1 00:15:31.891155 kernel: device-mapper: uevent: version 1.0.3 Nov 1 00:15:31.893087 kernel: device-mapper: ioctl: 4.48.0-ioctl (2023-03-01) initialised: dm-devel@redhat.com Nov 1 00:15:31.937805 kernel: raid6: avx2x4 gen() 27130 MB/s Nov 1 00:15:31.954792 kernel: raid6: avx2x2 gen() 25987 MB/s Nov 1 00:15:31.972604 kernel: raid6: avx2x1 gen() 23742 MB/s Nov 1 00:15:31.972680 kernel: raid6: using algorithm avx2x4 gen() 27130 MB/s Nov 1 00:15:32.016791 kernel: raid6: .... xor() 7822 MB/s, rmw enabled Nov 1 00:15:32.016907 kernel: raid6: using avx2x2 recovery algorithm Nov 1 00:15:32.054790 kernel: xor: automatically using best checksumming function avx Nov 1 00:15:32.228789 kernel: Btrfs loaded, zoned=no, fsverity=no Nov 1 00:15:32.242143 systemd[1]: Finished dracut-pre-udev.service - dracut pre-udev hook. Nov 1 00:15:32.262985 systemd[1]: Starting systemd-udevd.service - Rule-based Manager for Device Events and Files... Nov 1 00:15:32.315367 systemd-udevd[415]: Using default interface naming scheme 'v255'. Nov 1 00:15:32.366363 systemd[1]: Started systemd-udevd.service - Rule-based Manager for Device Events and Files. Nov 1 00:15:32.375047 systemd[1]: Starting dracut-pre-trigger.service - dracut pre-trigger hook... Nov 1 00:15:32.393757 dracut-pre-trigger[422]: rd.md=0: removing MD RAID activation Nov 1 00:15:32.433212 systemd[1]: Finished dracut-pre-trigger.service - dracut pre-trigger hook. Nov 1 00:15:32.459948 systemd[1]: Starting systemd-udev-trigger.service - Coldplug All udev Devices... Nov 1 00:15:32.533434 systemd[1]: Finished systemd-udev-trigger.service - Coldplug All udev Devices. Nov 1 00:15:32.544952 systemd[1]: Starting dracut-initqueue.service - dracut initqueue hook... Nov 1 00:15:32.573427 systemd[1]: Finished dracut-initqueue.service - dracut initqueue hook. Nov 1 00:15:32.574720 systemd[1]: Reached target remote-fs-pre.target - Preparation for Remote File Systems. Nov 1 00:15:32.579865 systemd[1]: Reached target remote-cryptsetup.target - Remote Encrypted Volumes. Nov 1 00:15:32.587295 systemd[1]: Reached target remote-fs.target - Remote File Systems. Nov 1 00:15:32.591776 kernel: virtio_blk virtio1: 4/0/0 default/read/poll queues Nov 1 00:15:32.620978 kernel: virtio_blk virtio1: [vda] 19775488 512-byte logical blocks (10.1 GB/9.43 GiB) Nov 1 00:15:32.622850 kernel: cryptd: max_cpu_qlen set to 1000 Nov 1 00:15:32.626026 systemd[1]: Starting dracut-pre-mount.service - dracut pre-mount hook... Nov 1 00:15:32.635958 systemd[1]: dracut-cmdline-ask.service: Deactivated successfully. Nov 1 00:15:32.645048 kernel: GPT:Primary header thinks Alt. header is not at the end of the disk. Nov 1 00:15:32.645076 kernel: GPT:9289727 != 19775487 Nov 1 00:15:32.645099 kernel: GPT:Alternate GPT header not at the end of the disk. Nov 1 00:15:32.645130 kernel: GPT:9289727 != 19775487 Nov 1 00:15:32.645150 kernel: GPT: Use GNU Parted to correct GPT errors. Nov 1 00:15:32.645173 kernel: vda: vda1 vda2 vda3 vda4 vda6 vda7 vda9 Nov 1 00:15:32.637865 systemd[1]: Stopped dracut-cmdline-ask.service - dracut ask for additional cmdline parameters. Nov 1 00:15:32.651004 systemd[1]: Stopping dracut-cmdline-ask.service - dracut ask for additional cmdline parameters... Nov 1 00:15:32.657893 systemd[1]: systemd-vconsole-setup.service: Deactivated successfully. Nov 1 00:15:32.661003 kernel: AVX2 version of gcm_enc/dec engaged. Nov 1 00:15:32.661033 kernel: AES CTR mode by8 optimization enabled Nov 1 00:15:32.661049 kernel: libata version 3.00 loaded. Nov 1 00:15:32.658202 systemd[1]: Stopped systemd-vconsole-setup.service - Virtual Console Setup. Nov 1 00:15:32.673377 systemd[1]: Stopping systemd-vconsole-setup.service - Virtual Console Setup... Nov 1 00:15:32.693134 kernel: BTRFS: device label OEM devid 1 transid 9 /dev/vda6 scanned by (udev-worker) (474) Nov 1 00:15:32.696849 kernel: BTRFS: device fsid 5d5360dd-ce7d-46d0-bc66-772f2084023b devid 1 transid 34 /dev/vda3 scanned by (udev-worker) (473) Nov 1 00:15:32.696922 kernel: ahci 0000:00:1f.2: version 3.0 Nov 1 00:15:32.698366 systemd[1]: Starting systemd-vconsole-setup.service - Virtual Console Setup... Nov 1 00:15:32.704288 kernel: ACPI: \_SB_.GSIA: Enabled at IRQ 16 Nov 1 00:15:32.704325 kernel: ahci 0000:00:1f.2: AHCI 0001.0000 32 slots 6 ports 1.5 Gbps 0x3f impl SATA mode Nov 1 00:15:32.707149 kernel: ahci 0000:00:1f.2: flags: 64bit ncq only Nov 1 00:15:32.708352 systemd[1]: Finished dracut-pre-mount.service - dracut pre-mount hook. Nov 1 00:15:32.714773 kernel: scsi host0: ahci Nov 1 00:15:32.718127 kernel: scsi host1: ahci Nov 1 00:15:32.719949 kernel: scsi host2: ahci Nov 1 00:15:32.722431 kernel: scsi host3: ahci Nov 1 00:15:32.722788 kernel: scsi host4: ahci Nov 1 00:15:32.726786 kernel: scsi host5: ahci Nov 1 00:15:32.727077 kernel: ata1: SATA max UDMA/133 abar m4096@0xc1040000 port 0xc1040100 irq 34 Nov 1 00:15:32.727090 kernel: ata2: SATA max UDMA/133 abar m4096@0xc1040000 port 0xc1040180 irq 34 Nov 1 00:15:32.727487 kernel: ata3: SATA max UDMA/133 abar m4096@0xc1040000 port 0xc1040200 irq 34 Nov 1 00:15:32.730276 kernel: ata4: SATA max UDMA/133 abar m4096@0xc1040000 port 0xc1040280 irq 34 Nov 1 00:15:32.730303 kernel: ata5: SATA max UDMA/133 abar m4096@0xc1040000 port 0xc1040300 irq 34 Nov 1 00:15:32.733100 kernel: ata6: SATA max UDMA/133 abar m4096@0xc1040000 port 0xc1040380 irq 34 Nov 1 00:15:32.752890 systemd[1]: Found device dev-disk-by\x2dlabel-ROOT.device - /dev/disk/by-label/ROOT. Nov 1 00:15:32.772861 systemd[1]: Found device dev-disk-by\x2dlabel-EFI\x2dSYSTEM.device - /dev/disk/by-label/EFI-SYSTEM. Nov 1 00:15:32.782565 systemd[1]: Found device dev-disk-by\x2dlabel-OEM.device - /dev/disk/by-label/OEM. Nov 1 00:15:32.804581 systemd[1]: Found device dev-disk-by\x2dpartlabel-USR\x2dA.device - /dev/disk/by-partlabel/USR-A. Nov 1 00:15:32.820072 systemd[1]: Found device dev-disk-by\x2dpartuuid-7130c94a\x2d213a\x2d4e5a\x2d8e26\x2d6cce9662f132.device - /dev/disk/by-partuuid/7130c94a-213a-4e5a-8e26-6cce9662f132. Nov 1 00:15:32.838016 systemd[1]: Starting disk-uuid.service - Generate new UUID for disk GPT if necessary... Nov 1 00:15:32.842509 systemd[1]: systemd-vconsole-setup.service: Deactivated successfully. Nov 1 00:15:32.842629 systemd[1]: Stopped systemd-vconsole-setup.service - Virtual Console Setup. Nov 1 00:15:32.846779 systemd[1]: Stopping systemd-vconsole-setup.service - Virtual Console Setup... Nov 1 00:15:32.853002 systemd[1]: Starting systemd-vconsole-setup.service - Virtual Console Setup... Nov 1 00:15:32.889480 systemd[1]: Finished systemd-vconsole-setup.service - Virtual Console Setup. Nov 1 00:15:32.903954 systemd[1]: Starting dracut-cmdline-ask.service - dracut ask for additional cmdline parameters... Nov 1 00:15:32.937387 systemd[1]: Finished dracut-cmdline-ask.service - dracut ask for additional cmdline parameters. Nov 1 00:15:32.983736 disk-uuid[559]: Primary Header is updated. Nov 1 00:15:32.983736 disk-uuid[559]: Secondary Entries is updated. Nov 1 00:15:32.983736 disk-uuid[559]: Secondary Header is updated. Nov 1 00:15:32.990430 kernel: vda: vda1 vda2 vda3 vda4 vda6 vda7 vda9 Nov 1 00:15:33.039841 kernel: vda: vda1 vda2 vda3 vda4 vda6 vda7 vda9 Nov 1 00:15:33.047767 kernel: ata4: SATA link down (SStatus 0 SControl 300) Nov 1 00:15:33.047807 kernel: ata5: SATA link down (SStatus 0 SControl 300) Nov 1 00:15:33.047822 kernel: ata6: SATA link down (SStatus 0 SControl 300) Nov 1 00:15:33.054433 kernel: ata2: SATA link down (SStatus 0 SControl 300) Nov 1 00:15:33.054464 kernel: ata1: SATA link down (SStatus 0 SControl 300) Nov 1 00:15:33.056278 kernel: ata3: SATA link up 1.5 Gbps (SStatus 113 SControl 300) Nov 1 00:15:33.058722 kernel: ata3.00: ATAPI: QEMU DVD-ROM, 2.5+, max UDMA/100 Nov 1 00:15:33.058770 kernel: ata3.00: applying bridge limits Nov 1 00:15:33.060769 kernel: ata3.00: configured for UDMA/100 Nov 1 00:15:33.062780 kernel: scsi 2:0:0:0: CD-ROM QEMU QEMU DVD-ROM 2.5+ PQ: 0 ANSI: 5 Nov 1 00:15:33.122909 kernel: sr 2:0:0:0: [sr0] scsi3-mmc drive: 4x/4x cd/rw xa/form2 tray Nov 1 00:15:33.123246 kernel: cdrom: Uniform CD-ROM driver Revision: 3.20 Nov 1 00:15:33.145807 kernel: sr 2:0:0:0: Attached scsi CD-ROM sr0 Nov 1 00:15:34.049907 kernel: vda: vda1 vda2 vda3 vda4 vda6 vda7 vda9 Nov 1 00:15:34.050609 disk-uuid[573]: The operation has completed successfully. Nov 1 00:15:34.103518 systemd[1]: disk-uuid.service: Deactivated successfully. Nov 1 00:15:34.103792 systemd[1]: Finished disk-uuid.service - Generate new UUID for disk GPT if necessary. Nov 1 00:15:34.128128 systemd[1]: Starting verity-setup.service - Verity Setup for /dev/mapper/usr... Nov 1 00:15:34.133982 sh[598]: Success Nov 1 00:15:34.152871 kernel: device-mapper: verity: sha256 using implementation "sha256-ni" Nov 1 00:15:34.199640 systemd[1]: Found device dev-mapper-usr.device - /dev/mapper/usr. Nov 1 00:15:34.212091 systemd[1]: Mounting sysusr-usr.mount - /sysusr/usr... Nov 1 00:15:34.215545 systemd[1]: Finished verity-setup.service - Verity Setup for /dev/mapper/usr. Nov 1 00:15:34.234529 kernel: BTRFS info (device dm-0): first mount of filesystem 5d5360dd-ce7d-46d0-bc66-772f2084023b Nov 1 00:15:34.234582 kernel: BTRFS info (device dm-0): using crc32c (crc32c-intel) checksum algorithm Nov 1 00:15:34.234596 kernel: BTRFS warning (device dm-0): 'nologreplay' is deprecated, use 'rescue=nologreplay' instead Nov 1 00:15:34.236957 kernel: BTRFS info (device dm-0): disabling log replay at mount time Nov 1 00:15:34.239492 kernel: BTRFS info (device dm-0): using free space tree Nov 1 00:15:34.256893 systemd[1]: Mounted sysusr-usr.mount - /sysusr/usr. Nov 1 00:15:34.259078 systemd[1]: afterburn-network-kargs.service - Afterburn Initrd Setup Network Kernel Arguments was skipped because no trigger condition checks were met. Nov 1 00:15:34.269984 systemd[1]: Starting ignition-setup.service - Ignition (setup)... Nov 1 00:15:34.272571 systemd[1]: Starting parse-ip-for-networkd.service - Write systemd-networkd units from cmdline... Nov 1 00:15:34.288696 kernel: BTRFS info (device vda6): first mount of filesystem 92f9034d-7d56-482a-b71a-15e476525571 Nov 1 00:15:34.288778 kernel: BTRFS info (device vda6): using crc32c (crc32c-intel) checksum algorithm Nov 1 00:15:34.288792 kernel: BTRFS info (device vda6): using free space tree Nov 1 00:15:34.295776 kernel: BTRFS info (device vda6): auto enabling async discard Nov 1 00:15:34.310644 systemd[1]: mnt-oem.mount: Deactivated successfully. Nov 1 00:15:34.313989 kernel: BTRFS info (device vda6): last unmount of filesystem 92f9034d-7d56-482a-b71a-15e476525571 Nov 1 00:15:34.329501 systemd[1]: Finished ignition-setup.service - Ignition (setup). Nov 1 00:15:34.338051 systemd[1]: Starting ignition-fetch-offline.service - Ignition (fetch-offline)... Nov 1 00:15:34.416137 ignition[700]: Ignition 2.19.0 Nov 1 00:15:34.416162 ignition[700]: Stage: fetch-offline Nov 1 00:15:34.416223 ignition[700]: no configs at "/usr/lib/ignition/base.d" Nov 1 00:15:34.416244 ignition[700]: no config dir at "/usr/lib/ignition/base.platform.d/qemu" Nov 1 00:15:34.416381 ignition[700]: parsed url from cmdline: "" Nov 1 00:15:34.416387 ignition[700]: no config URL provided Nov 1 00:15:34.416396 ignition[700]: reading system config file "/usr/lib/ignition/user.ign" Nov 1 00:15:34.416410 ignition[700]: no config at "/usr/lib/ignition/user.ign" Nov 1 00:15:34.416447 ignition[700]: op(1): [started] loading QEMU firmware config module Nov 1 00:15:34.416454 ignition[700]: op(1): executing: "modprobe" "qemu_fw_cfg" Nov 1 00:15:34.434588 ignition[700]: op(1): [finished] loading QEMU firmware config module Nov 1 00:15:34.434628 ignition[700]: QEMU firmware config was not found. Ignoring... Nov 1 00:15:34.437015 ignition[700]: parsing config with SHA512: 652a02bf035342ffe0590c12f006a7f44ae1e59871f686d2fef474d9c31e04492904eb79e85509a41e7c9db6f1cbac298ebce7416c5c2167b92aa1063fba7cef Nov 1 00:15:34.440670 unknown[700]: fetched base config from "system" Nov 1 00:15:34.440683 unknown[700]: fetched user config from "qemu" Nov 1 00:15:34.441001 ignition[700]: fetch-offline: fetch-offline passed Nov 1 00:15:34.441077 ignition[700]: Ignition finished successfully Nov 1 00:15:34.449082 systemd[1]: Finished ignition-fetch-offline.service - Ignition (fetch-offline). Nov 1 00:15:34.455134 systemd[1]: Finished parse-ip-for-networkd.service - Write systemd-networkd units from cmdline. Nov 1 00:15:34.471936 systemd[1]: Starting systemd-networkd.service - Network Configuration... Nov 1 00:15:34.498587 systemd-networkd[787]: lo: Link UP Nov 1 00:15:34.498600 systemd-networkd[787]: lo: Gained carrier Nov 1 00:15:34.500645 systemd-networkd[787]: Enumeration completed Nov 1 00:15:34.500907 systemd[1]: Started systemd-networkd.service - Network Configuration. Nov 1 00:15:34.501152 systemd-networkd[787]: eth0: found matching network '/usr/lib/systemd/network/zz-default.network', based on potentially unpredictable interface name. Nov 1 00:15:34.501157 systemd-networkd[787]: eth0: Configuring with /usr/lib/systemd/network/zz-default.network. Nov 1 00:15:34.504783 systemd-networkd[787]: eth0: Link UP Nov 1 00:15:34.504788 systemd-networkd[787]: eth0: Gained carrier Nov 1 00:15:34.504796 systemd-networkd[787]: eth0: found matching network '/usr/lib/systemd/network/zz-default.network', based on potentially unpredictable interface name. Nov 1 00:15:34.505038 systemd[1]: Reached target network.target - Network. Nov 1 00:15:34.507801 systemd[1]: ignition-fetch.service - Ignition (fetch) was skipped because of an unmet condition check (ConditionPathExists=!/run/ignition.json). Nov 1 00:15:34.519077 systemd[1]: Starting ignition-kargs.service - Ignition (kargs)... Nov 1 00:15:34.533886 systemd-networkd[787]: eth0: DHCPv4 address 10.0.0.42/16, gateway 10.0.0.1 acquired from 10.0.0.1 Nov 1 00:15:34.610664 ignition[789]: Ignition 2.19.0 Nov 1 00:15:34.610682 ignition[789]: Stage: kargs Nov 1 00:15:34.610929 ignition[789]: no configs at "/usr/lib/ignition/base.d" Nov 1 00:15:34.610942 ignition[789]: no config dir at "/usr/lib/ignition/base.platform.d/qemu" Nov 1 00:15:34.615192 ignition[789]: kargs: kargs passed Nov 1 00:15:34.620452 systemd[1]: Finished ignition-kargs.service - Ignition (kargs). Nov 1 00:15:34.615254 ignition[789]: Ignition finished successfully Nov 1 00:15:34.633272 systemd[1]: Starting ignition-disks.service - Ignition (disks)... Nov 1 00:15:34.712515 ignition[798]: Ignition 2.19.0 Nov 1 00:15:34.712532 ignition[798]: Stage: disks Nov 1 00:15:34.712871 ignition[798]: no configs at "/usr/lib/ignition/base.d" Nov 1 00:15:34.712904 ignition[798]: no config dir at "/usr/lib/ignition/base.platform.d/qemu" Nov 1 00:15:34.740366 ignition[798]: disks: disks passed Nov 1 00:15:34.741946 ignition[798]: Ignition finished successfully Nov 1 00:15:34.744995 systemd[1]: Finished ignition-disks.service - Ignition (disks). Nov 1 00:15:34.749358 systemd[1]: Reached target initrd-root-device.target - Initrd Root Device. Nov 1 00:15:34.754062 systemd[1]: Reached target local-fs-pre.target - Preparation for Local File Systems. Nov 1 00:15:34.762707 systemd[1]: Reached target local-fs.target - Local File Systems. Nov 1 00:15:34.767053 systemd[1]: Reached target sysinit.target - System Initialization. Nov 1 00:15:34.771657 systemd[1]: Reached target basic.target - Basic System. Nov 1 00:15:34.790659 systemd-resolved[263]: Detected conflict on linux IN A 10.0.0.42 Nov 1 00:15:34.790679 systemd-resolved[263]: Hostname conflict, changing published hostname from 'linux' to 'linux4'. Nov 1 00:15:34.805099 systemd[1]: Starting systemd-fsck-root.service - File System Check on /dev/disk/by-label/ROOT... Nov 1 00:15:34.820912 systemd-fsck[808]: ROOT: clean, 14/553520 files, 52654/553472 blocks Nov 1 00:15:35.048989 systemd[1]: Finished systemd-fsck-root.service - File System Check on /dev/disk/by-label/ROOT. Nov 1 00:15:35.065012 systemd[1]: Mounting sysroot.mount - /sysroot... Nov 1 00:15:35.242830 kernel: EXT4-fs (vda9): mounted filesystem cb9d31b8-5e00-461c-b45e-c304d1f8091c r/w with ordered data mode. Quota mode: none. Nov 1 00:15:35.244520 systemd[1]: Mounted sysroot.mount - /sysroot. Nov 1 00:15:35.246897 systemd[1]: Reached target initrd-root-fs.target - Initrd Root File System. Nov 1 00:15:35.262864 systemd[1]: Mounting sysroot-oem.mount - /sysroot/oem... Nov 1 00:15:35.269965 systemd[1]: Mounting sysroot-usr.mount - /sysroot/usr... Nov 1 00:15:35.275800 kernel: BTRFS: device label OEM devid 1 transid 10 /dev/vda6 scanned by mount (816) Nov 1 00:15:35.274455 systemd[1]: flatcar-metadata-hostname.service - Flatcar Metadata Hostname Agent was skipped because no trigger condition checks were met. Nov 1 00:15:35.274524 systemd[1]: ignition-remount-sysroot.service - Remount /sysroot read-write for Ignition was skipped because of an unmet condition check (ConditionPathIsReadWrite=!/sysroot). Nov 1 00:15:35.290433 kernel: BTRFS info (device vda6): first mount of filesystem 92f9034d-7d56-482a-b71a-15e476525571 Nov 1 00:15:35.290464 kernel: BTRFS info (device vda6): using crc32c (crc32c-intel) checksum algorithm Nov 1 00:15:35.290475 kernel: BTRFS info (device vda6): using free space tree Nov 1 00:15:35.274558 systemd[1]: Reached target ignition-diskful.target - Ignition Boot Disk Setup. Nov 1 00:15:35.285460 systemd[1]: Mounted sysroot-usr.mount - /sysroot/usr. Nov 1 00:15:35.300094 kernel: BTRFS info (device vda6): auto enabling async discard Nov 1 00:15:35.293235 systemd[1]: Starting initrd-setup-root.service - Root filesystem setup... Nov 1 00:15:35.304214 systemd[1]: Mounted sysroot-oem.mount - /sysroot/oem. Nov 1 00:15:35.357771 initrd-setup-root[840]: cut: /sysroot/etc/passwd: No such file or directory Nov 1 00:15:35.366401 initrd-setup-root[847]: cut: /sysroot/etc/group: No such file or directory Nov 1 00:15:35.375102 initrd-setup-root[854]: cut: /sysroot/etc/shadow: No such file or directory Nov 1 00:15:35.382542 initrd-setup-root[861]: cut: /sysroot/etc/gshadow: No such file or directory Nov 1 00:15:35.529474 systemd[1]: Finished initrd-setup-root.service - Root filesystem setup. Nov 1 00:15:35.537860 systemd[1]: Starting ignition-mount.service - Ignition (mount)... Nov 1 00:15:35.541328 systemd[1]: Starting sysroot-boot.service - /sysroot/boot... Nov 1 00:15:35.550789 systemd[1]: sysroot-oem.mount: Deactivated successfully. Nov 1 00:15:35.553322 kernel: BTRFS info (device vda6): last unmount of filesystem 92f9034d-7d56-482a-b71a-15e476525571 Nov 1 00:15:35.578895 systemd[1]: Finished sysroot-boot.service - /sysroot/boot. Nov 1 00:15:35.585963 ignition[928]: INFO : Ignition 2.19.0 Nov 1 00:15:35.585963 ignition[928]: INFO : Stage: mount Nov 1 00:15:35.588961 ignition[928]: INFO : no configs at "/usr/lib/ignition/base.d" Nov 1 00:15:35.588961 ignition[928]: INFO : no config dir at "/usr/lib/ignition/base.platform.d/qemu" Nov 1 00:15:35.588961 ignition[928]: INFO : mount: mount passed Nov 1 00:15:35.588961 ignition[928]: INFO : Ignition finished successfully Nov 1 00:15:35.589933 systemd[1]: Finished ignition-mount.service - Ignition (mount). Nov 1 00:15:35.600913 systemd[1]: Starting ignition-files.service - Ignition (files)... Nov 1 00:15:36.258997 systemd[1]: Mounting sysroot-oem.mount - /sysroot/oem... Nov 1 00:15:36.274834 kernel: BTRFS: device label OEM devid 1 transid 11 /dev/vda6 scanned by mount (942) Nov 1 00:15:36.278959 systemd-networkd[787]: eth0: Gained IPv6LL Nov 1 00:15:36.287904 kernel: BTRFS info (device vda6): first mount of filesystem 92f9034d-7d56-482a-b71a-15e476525571 Nov 1 00:15:36.287939 kernel: BTRFS info (device vda6): using crc32c (crc32c-intel) checksum algorithm Nov 1 00:15:36.287952 kernel: BTRFS info (device vda6): using free space tree Nov 1 00:15:36.292907 kernel: BTRFS info (device vda6): auto enabling async discard Nov 1 00:15:36.294119 systemd[1]: Mounted sysroot-oem.mount - /sysroot/oem. Nov 1 00:15:36.343801 ignition[959]: INFO : Ignition 2.19.0 Nov 1 00:15:36.343801 ignition[959]: INFO : Stage: files Nov 1 00:15:36.346960 ignition[959]: INFO : no configs at "/usr/lib/ignition/base.d" Nov 1 00:15:36.346960 ignition[959]: INFO : no config dir at "/usr/lib/ignition/base.platform.d/qemu" Nov 1 00:15:36.346960 ignition[959]: DEBUG : files: compiled without relabeling support, skipping Nov 1 00:15:36.352989 ignition[959]: INFO : files: ensureUsers: op(1): [started] creating or modifying user "core" Nov 1 00:15:36.352989 ignition[959]: DEBUG : files: ensureUsers: op(1): executing: "usermod" "--root" "/sysroot" "core" Nov 1 00:15:36.359237 ignition[959]: INFO : files: ensureUsers: op(1): [finished] creating or modifying user "core" Nov 1 00:15:36.361603 ignition[959]: INFO : files: ensureUsers: op(2): [started] adding ssh keys to user "core" Nov 1 00:15:36.364301 unknown[959]: wrote ssh authorized keys file for user: core Nov 1 00:15:36.366131 ignition[959]: INFO : files: ensureUsers: op(2): [finished] adding ssh keys to user "core" Nov 1 00:15:36.368616 ignition[959]: INFO : files: createFilesystemsFiles: createFiles: op(3): [started] writing file "/sysroot/home/core/install.sh" Nov 1 00:15:36.371665 ignition[959]: INFO : files: createFilesystemsFiles: createFiles: op(3): [finished] writing file "/sysroot/home/core/install.sh" Nov 1 00:15:36.371665 ignition[959]: INFO : files: createFilesystemsFiles: createFiles: op(4): [started] writing file "/sysroot/etc/flatcar/update.conf" Nov 1 00:15:36.371665 ignition[959]: INFO : files: createFilesystemsFiles: createFiles: op(4): [finished] writing file "/sysroot/etc/flatcar/update.conf" Nov 1 00:15:36.371665 ignition[959]: INFO : files: createFilesystemsFiles: createFiles: op(5): [started] writing link "/sysroot/etc/extensions/kubernetes.raw" -> "/opt/extensions/kubernetes/kubernetes-v1.32.4-x86-64.raw" Nov 1 00:15:36.371665 ignition[959]: INFO : files: createFilesystemsFiles: createFiles: op(5): [finished] writing link "/sysroot/etc/extensions/kubernetes.raw" -> "/opt/extensions/kubernetes/kubernetes-v1.32.4-x86-64.raw" Nov 1 00:15:36.371665 ignition[959]: INFO : files: createFilesystemsFiles: createFiles: op(6): [started] writing file "/sysroot/opt/extensions/kubernetes/kubernetes-v1.32.4-x86-64.raw" Nov 1 00:15:36.371665 ignition[959]: INFO : files: createFilesystemsFiles: createFiles: op(6): GET https://extensions.flatcar.org/extensions/kubernetes-v1.32.4-x86-64.raw: attempt #1 Nov 1 00:15:36.708581 ignition[959]: INFO : files: createFilesystemsFiles: createFiles: op(6): GET result: OK Nov 1 00:15:37.488718 ignition[959]: INFO : files: createFilesystemsFiles: createFiles: op(6): [finished] writing file "/sysroot/opt/extensions/kubernetes/kubernetes-v1.32.4-x86-64.raw" Nov 1 00:15:37.488718 ignition[959]: INFO : files: op(7): [started] processing unit "coreos-metadata.service" Nov 1 00:15:37.495717 ignition[959]: INFO : files: op(7): op(8): [started] writing unit "coreos-metadata.service" at "/sysroot/etc/systemd/system/coreos-metadata.service" Nov 1 00:15:37.499738 ignition[959]: INFO : files: op(7): op(8): [finished] writing unit "coreos-metadata.service" at "/sysroot/etc/systemd/system/coreos-metadata.service" Nov 1 00:15:37.499738 ignition[959]: INFO : files: op(7): [finished] processing unit "coreos-metadata.service" Nov 1 00:15:37.499738 ignition[959]: INFO : files: op(9): [started] setting preset to disabled for "coreos-metadata.service" Nov 1 00:15:37.573005 ignition[959]: INFO : files: op(9): op(a): [started] removing enablement symlink(s) for "coreos-metadata.service" Nov 1 00:15:37.581822 ignition[959]: INFO : files: op(9): op(a): [finished] removing enablement symlink(s) for "coreos-metadata.service" Nov 1 00:15:37.588324 ignition[959]: INFO : files: op(9): [finished] setting preset to disabled for "coreos-metadata.service" Nov 1 00:15:37.588324 ignition[959]: INFO : files: createResultFile: createFiles: op(b): [started] writing file "/sysroot/etc/.ignition-result.json" Nov 1 00:15:37.588324 ignition[959]: INFO : files: createResultFile: createFiles: op(b): [finished] writing file "/sysroot/etc/.ignition-result.json" Nov 1 00:15:37.588324 ignition[959]: INFO : files: files passed Nov 1 00:15:37.588324 ignition[959]: INFO : Ignition finished successfully Nov 1 00:15:37.585786 systemd[1]: Finished ignition-files.service - Ignition (files). Nov 1 00:15:37.604033 systemd[1]: Starting ignition-quench.service - Ignition (record completion)... Nov 1 00:15:37.607562 systemd[1]: Starting initrd-setup-root-after-ignition.service - Root filesystem completion... Nov 1 00:15:37.617243 systemd[1]: ignition-quench.service: Deactivated successfully. Nov 1 00:15:37.625962 initrd-setup-root-after-ignition[986]: grep: /sysroot/oem/oem-release: No such file or directory Nov 1 00:15:37.617437 systemd[1]: Finished ignition-quench.service - Ignition (record completion). Nov 1 00:15:37.634525 initrd-setup-root-after-ignition[989]: grep: /sysroot/etc/flatcar/enabled-sysext.conf: No such file or directory Nov 1 00:15:37.634525 initrd-setup-root-after-ignition[989]: grep: /sysroot/usr/share/flatcar/enabled-sysext.conf: No such file or directory Nov 1 00:15:37.626945 systemd[1]: Finished initrd-setup-root-after-ignition.service - Root filesystem completion. Nov 1 00:15:37.642478 initrd-setup-root-after-ignition[993]: grep: /sysroot/etc/flatcar/enabled-sysext.conf: No such file or directory Nov 1 00:15:37.631318 systemd[1]: Reached target ignition-complete.target - Ignition Complete. Nov 1 00:15:37.650077 systemd[1]: Starting initrd-parse-etc.service - Mountpoints Configured in the Real Root... Nov 1 00:15:37.690417 systemd[1]: initrd-parse-etc.service: Deactivated successfully. Nov 1 00:15:37.690796 systemd[1]: Finished initrd-parse-etc.service - Mountpoints Configured in the Real Root. Nov 1 00:15:37.695040 systemd[1]: Reached target initrd-fs.target - Initrd File Systems. Nov 1 00:15:37.698875 systemd[1]: Reached target initrd.target - Initrd Default Target. Nov 1 00:15:37.702352 systemd[1]: dracut-mount.service - dracut mount hook was skipped because no trigger condition checks were met. Nov 1 00:15:37.703732 systemd[1]: Starting dracut-pre-pivot.service - dracut pre-pivot and cleanup hook... Nov 1 00:15:37.731062 systemd[1]: Finished dracut-pre-pivot.service - dracut pre-pivot and cleanup hook. Nov 1 00:15:37.745954 systemd[1]: Starting initrd-cleanup.service - Cleaning Up and Shutting Down Daemons... Nov 1 00:15:37.759157 systemd[1]: Stopped target nss-lookup.target - Host and Network Name Lookups. Nov 1 00:15:37.761500 systemd[1]: Stopped target remote-cryptsetup.target - Remote Encrypted Volumes. Nov 1 00:15:37.765579 systemd[1]: Stopped target timers.target - Timer Units. Nov 1 00:15:37.769568 systemd[1]: dracut-pre-pivot.service: Deactivated successfully. Nov 1 00:15:37.769808 systemd[1]: Stopped dracut-pre-pivot.service - dracut pre-pivot and cleanup hook. Nov 1 00:15:37.774365 systemd[1]: Stopped target initrd.target - Initrd Default Target. Nov 1 00:15:37.777498 systemd[1]: Stopped target basic.target - Basic System. Nov 1 00:15:37.782662 systemd[1]: Stopped target ignition-complete.target - Ignition Complete. Nov 1 00:15:37.785652 systemd[1]: Stopped target ignition-diskful.target - Ignition Boot Disk Setup. Nov 1 00:15:37.789350 systemd[1]: Stopped target initrd-root-device.target - Initrd Root Device. Nov 1 00:15:37.792921 systemd[1]: Stopped target remote-fs.target - Remote File Systems. Nov 1 00:15:37.798953 systemd[1]: Stopped target remote-fs-pre.target - Preparation for Remote File Systems. Nov 1 00:15:37.803314 systemd[1]: Stopped target sysinit.target - System Initialization. Nov 1 00:15:37.807506 systemd[1]: Stopped target local-fs.target - Local File Systems. Nov 1 00:15:37.811513 systemd[1]: Stopped target swap.target - Swaps. Nov 1 00:15:37.814783 systemd[1]: dracut-pre-mount.service: Deactivated successfully. Nov 1 00:15:37.814990 systemd[1]: Stopped dracut-pre-mount.service - dracut pre-mount hook. Nov 1 00:15:37.819674 systemd[1]: Stopped target cryptsetup.target - Local Encrypted Volumes. Nov 1 00:15:37.822839 systemd[1]: Stopped target cryptsetup-pre.target - Local Encrypted Volumes (Pre). Nov 1 00:15:37.828929 systemd[1]: clevis-luks-askpass.path: Deactivated successfully. Nov 1 00:15:37.829154 systemd[1]: Stopped clevis-luks-askpass.path - Forward Password Requests to Clevis Directory Watch. Nov 1 00:15:37.832043 systemd[1]: dracut-initqueue.service: Deactivated successfully. Nov 1 00:15:37.832292 systemd[1]: Stopped dracut-initqueue.service - dracut initqueue hook. Nov 1 00:15:37.842310 systemd[1]: ignition-fetch-offline.service: Deactivated successfully. Nov 1 00:15:37.842476 systemd[1]: Stopped ignition-fetch-offline.service - Ignition (fetch-offline). Nov 1 00:15:37.845257 systemd[1]: Stopped target paths.target - Path Units. Nov 1 00:15:37.848676 systemd[1]: systemd-ask-password-console.path: Deactivated successfully. Nov 1 00:15:37.848899 systemd[1]: Stopped systemd-ask-password-console.path - Dispatch Password Requests to Console Directory Watch. Nov 1 00:15:37.852560 systemd[1]: Stopped target slices.target - Slice Units. Nov 1 00:15:37.856579 systemd[1]: Stopped target sockets.target - Socket Units. Nov 1 00:15:37.859888 systemd[1]: iscsid.socket: Deactivated successfully. Nov 1 00:15:37.860078 systemd[1]: Closed iscsid.socket - Open-iSCSI iscsid Socket. Nov 1 00:15:37.863480 systemd[1]: iscsiuio.socket: Deactivated successfully. Nov 1 00:15:37.863656 systemd[1]: Closed iscsiuio.socket - Open-iSCSI iscsiuio Socket. Nov 1 00:15:37.866972 systemd[1]: initrd-setup-root-after-ignition.service: Deactivated successfully. Nov 1 00:15:37.867099 systemd[1]: Stopped initrd-setup-root-after-ignition.service - Root filesystem completion. Nov 1 00:15:37.899270 ignition[1013]: INFO : Ignition 2.19.0 Nov 1 00:15:37.899270 ignition[1013]: INFO : Stage: umount Nov 1 00:15:37.899270 ignition[1013]: INFO : no configs at "/usr/lib/ignition/base.d" Nov 1 00:15:37.899270 ignition[1013]: INFO : no config dir at "/usr/lib/ignition/base.platform.d/qemu" Nov 1 00:15:37.899270 ignition[1013]: INFO : umount: umount passed Nov 1 00:15:37.899270 ignition[1013]: INFO : Ignition finished successfully Nov 1 00:15:37.870855 systemd[1]: ignition-files.service: Deactivated successfully. Nov 1 00:15:37.870975 systemd[1]: Stopped ignition-files.service - Ignition (files). Nov 1 00:15:37.882948 systemd[1]: Stopping ignition-mount.service - Ignition (mount)... Nov 1 00:15:37.886936 systemd[1]: Stopping sysroot-boot.service - /sysroot/boot... Nov 1 00:15:37.889123 systemd[1]: systemd-udev-trigger.service: Deactivated successfully. Nov 1 00:15:37.889392 systemd[1]: Stopped systemd-udev-trigger.service - Coldplug All udev Devices. Nov 1 00:15:37.893232 systemd[1]: dracut-pre-trigger.service: Deactivated successfully. Nov 1 00:15:37.893402 systemd[1]: Stopped dracut-pre-trigger.service - dracut pre-trigger hook. Nov 1 00:15:37.901718 systemd[1]: initrd-cleanup.service: Deactivated successfully. Nov 1 00:15:37.901917 systemd[1]: Finished initrd-cleanup.service - Cleaning Up and Shutting Down Daemons. Nov 1 00:15:37.904646 systemd[1]: ignition-mount.service: Deactivated successfully. Nov 1 00:15:37.904818 systemd[1]: Stopped ignition-mount.service - Ignition (mount). Nov 1 00:15:37.908825 systemd[1]: Stopped target network.target - Network. Nov 1 00:15:37.911674 systemd[1]: ignition-disks.service: Deactivated successfully. Nov 1 00:15:37.911782 systemd[1]: Stopped ignition-disks.service - Ignition (disks). Nov 1 00:15:37.914718 systemd[1]: ignition-kargs.service: Deactivated successfully. Nov 1 00:15:37.914830 systemd[1]: Stopped ignition-kargs.service - Ignition (kargs). Nov 1 00:15:37.918015 systemd[1]: ignition-setup.service: Deactivated successfully. Nov 1 00:15:37.918077 systemd[1]: Stopped ignition-setup.service - Ignition (setup). Nov 1 00:15:37.921482 systemd[1]: ignition-setup-pre.service: Deactivated successfully. Nov 1 00:15:37.921551 systemd[1]: Stopped ignition-setup-pre.service - Ignition env setup. Nov 1 00:15:37.924650 systemd[1]: Stopping systemd-networkd.service - Network Configuration... Nov 1 00:15:37.928295 systemd[1]: Stopping systemd-resolved.service - Network Name Resolution... Nov 1 00:15:37.930101 systemd-networkd[787]: eth0: DHCPv6 lease lost Nov 1 00:15:37.934759 systemd[1]: sysroot-boot.mount: Deactivated successfully. Nov 1 00:15:37.936137 systemd[1]: systemd-networkd.service: Deactivated successfully. Nov 1 00:15:37.936418 systemd[1]: Stopped systemd-networkd.service - Network Configuration. Nov 1 00:15:37.937284 systemd[1]: systemd-resolved.service: Deactivated successfully. Nov 1 00:15:37.937560 systemd[1]: Stopped systemd-resolved.service - Network Name Resolution. Nov 1 00:15:37.945013 systemd[1]: systemd-networkd.socket: Deactivated successfully. Nov 1 00:15:37.945101 systemd[1]: Closed systemd-networkd.socket - Network Service Netlink Socket. Nov 1 00:15:37.963824 systemd[1]: Stopping network-cleanup.service - Network Cleanup... Nov 1 00:15:37.967007 systemd[1]: parse-ip-for-networkd.service: Deactivated successfully. Nov 1 00:15:37.967096 systemd[1]: Stopped parse-ip-for-networkd.service - Write systemd-networkd units from cmdline. Nov 1 00:15:37.971094 systemd[1]: systemd-sysctl.service: Deactivated successfully. Nov 1 00:15:37.971184 systemd[1]: Stopped systemd-sysctl.service - Apply Kernel Variables. Nov 1 00:15:37.974687 systemd[1]: systemd-modules-load.service: Deactivated successfully. Nov 1 00:15:37.974784 systemd[1]: Stopped systemd-modules-load.service - Load Kernel Modules. Nov 1 00:15:37.978518 systemd[1]: systemd-tmpfiles-setup.service: Deactivated successfully. Nov 1 00:15:37.978604 systemd[1]: Stopped systemd-tmpfiles-setup.service - Create System Files and Directories. Nov 1 00:15:37.982762 systemd[1]: Stopping systemd-udevd.service - Rule-based Manager for Device Events and Files... Nov 1 00:15:38.001416 systemd[1]: network-cleanup.service: Deactivated successfully. Nov 1 00:15:38.001553 systemd[1]: Stopped network-cleanup.service - Network Cleanup. Nov 1 00:15:38.006178 systemd[1]: systemd-udevd.service: Deactivated successfully. Nov 1 00:15:38.006365 systemd[1]: Stopped systemd-udevd.service - Rule-based Manager for Device Events and Files. Nov 1 00:15:38.009559 systemd[1]: systemd-udevd-control.socket: Deactivated successfully. Nov 1 00:15:38.009641 systemd[1]: Closed systemd-udevd-control.socket - udev Control Socket. Nov 1 00:15:38.012703 systemd[1]: systemd-udevd-kernel.socket: Deactivated successfully. Nov 1 00:15:38.012832 systemd[1]: Closed systemd-udevd-kernel.socket - udev Kernel Socket. Nov 1 00:15:38.016765 systemd[1]: dracut-pre-udev.service: Deactivated successfully. Nov 1 00:15:38.016836 systemd[1]: Stopped dracut-pre-udev.service - dracut pre-udev hook. Nov 1 00:15:38.021053 systemd[1]: dracut-cmdline.service: Deactivated successfully. Nov 1 00:15:38.021108 systemd[1]: Stopped dracut-cmdline.service - dracut cmdline hook. Nov 1 00:15:38.025411 systemd[1]: dracut-cmdline-ask.service: Deactivated successfully. Nov 1 00:15:38.025471 systemd[1]: Stopped dracut-cmdline-ask.service - dracut ask for additional cmdline parameters. Nov 1 00:15:38.048006 systemd[1]: Starting initrd-udevadm-cleanup-db.service - Cleanup udev Database... Nov 1 00:15:38.050888 systemd[1]: systemd-tmpfiles-setup-dev.service: Deactivated successfully. Nov 1 00:15:38.050978 systemd[1]: Stopped systemd-tmpfiles-setup-dev.service - Create Static Device Nodes in /dev. Nov 1 00:15:38.054692 systemd[1]: systemd-tmpfiles-setup-dev-early.service: Deactivated successfully. Nov 1 00:15:38.054812 systemd[1]: Stopped systemd-tmpfiles-setup-dev-early.service - Create Static Device Nodes in /dev gracefully. Nov 1 00:15:38.058710 systemd[1]: kmod-static-nodes.service: Deactivated successfully. Nov 1 00:15:38.058805 systemd[1]: Stopped kmod-static-nodes.service - Create List of Static Device Nodes. Nov 1 00:15:38.062538 systemd[1]: systemd-vconsole-setup.service: Deactivated successfully. Nov 1 00:15:38.062592 systemd[1]: Stopped systemd-vconsole-setup.service - Virtual Console Setup. Nov 1 00:15:38.066664 systemd[1]: initrd-udevadm-cleanup-db.service: Deactivated successfully. Nov 1 00:15:38.066802 systemd[1]: Finished initrd-udevadm-cleanup-db.service - Cleanup udev Database. Nov 1 00:15:38.149810 systemd[1]: sysroot-boot.service: Deactivated successfully. Nov 1 00:15:38.150025 systemd[1]: Stopped sysroot-boot.service - /sysroot/boot. Nov 1 00:15:38.153937 systemd[1]: Reached target initrd-switch-root.target - Switch Root. Nov 1 00:15:38.156556 systemd[1]: initrd-setup-root.service: Deactivated successfully. Nov 1 00:15:38.156632 systemd[1]: Stopped initrd-setup-root.service - Root filesystem setup. Nov 1 00:15:38.169975 systemd[1]: Starting initrd-switch-root.service - Switch Root... Nov 1 00:15:38.180276 systemd[1]: Switching root. Nov 1 00:15:38.217076 systemd-journald[194]: Journal stopped Nov 1 00:15:39.760475 systemd-journald[194]: Received SIGTERM from PID 1 (systemd). Nov 1 00:15:39.760562 kernel: SELinux: policy capability network_peer_controls=1 Nov 1 00:15:39.760576 kernel: SELinux: policy capability open_perms=1 Nov 1 00:15:39.760594 kernel: SELinux: policy capability extended_socket_class=1 Nov 1 00:15:39.760617 kernel: SELinux: policy capability always_check_network=0 Nov 1 00:15:39.760628 kernel: SELinux: policy capability cgroup_seclabel=1 Nov 1 00:15:39.760640 kernel: SELinux: policy capability nnp_nosuid_transition=1 Nov 1 00:15:39.760652 kernel: SELinux: policy capability genfs_seclabel_symlinks=0 Nov 1 00:15:39.760685 kernel: SELinux: policy capability ioctl_skip_cloexec=0 Nov 1 00:15:39.760697 kernel: audit: type=1403 audit(1761956138.665:2): auid=4294967295 ses=4294967295 lsm=selinux res=1 Nov 1 00:15:39.760713 systemd[1]: Successfully loaded SELinux policy in 54.627ms. Nov 1 00:15:39.760733 systemd[1]: Relabeled /dev, /dev/shm, /run, /sys/fs/cgroup in 17.883ms. Nov 1 00:15:39.760779 systemd[1]: systemd 255 running in system mode (+PAM +AUDIT +SELINUX -APPARMOR +IMA +SMACK +SECCOMP +GCRYPT -GNUTLS +OPENSSL -ACL +BLKID +CURL +ELFUTILS -FIDO2 +IDN2 -IDN +IPTC +KMOD +LIBCRYPTSETUP +LIBFDISK +PCRE2 -PWQUALITY -P11KIT -QRENCODE +TPM2 +BZIP2 +LZ4 +XZ +ZLIB +ZSTD -BPF_FRAMEWORK -XKBCOMMON +UTMP -SYSVINIT default-hierarchy=unified) Nov 1 00:15:39.760792 systemd[1]: Detected virtualization kvm. Nov 1 00:15:39.760804 systemd[1]: Detected architecture x86-64. Nov 1 00:15:39.760820 systemd[1]: Detected first boot. Nov 1 00:15:39.760832 systemd[1]: Initializing machine ID from VM UUID. Nov 1 00:15:39.760844 zram_generator::config[1056]: No configuration found. Nov 1 00:15:39.760858 systemd[1]: Populated /etc with preset unit settings. Nov 1 00:15:39.760870 systemd[1]: initrd-switch-root.service: Deactivated successfully. Nov 1 00:15:39.760882 systemd[1]: Stopped initrd-switch-root.service - Switch Root. Nov 1 00:15:39.760894 systemd[1]: systemd-journald.service: Scheduled restart job, restart counter is at 1. Nov 1 00:15:39.760906 systemd[1]: Created slice system-addon\x2dconfig.slice - Slice /system/addon-config. Nov 1 00:15:39.760919 systemd[1]: Created slice system-addon\x2drun.slice - Slice /system/addon-run. Nov 1 00:15:39.760936 systemd[1]: Created slice system-getty.slice - Slice /system/getty. Nov 1 00:15:39.760948 systemd[1]: Created slice system-modprobe.slice - Slice /system/modprobe. Nov 1 00:15:39.760961 systemd[1]: Created slice system-serial\x2dgetty.slice - Slice /system/serial-getty. Nov 1 00:15:39.760973 systemd[1]: Created slice system-system\x2dcloudinit.slice - Slice /system/system-cloudinit. Nov 1 00:15:39.760985 systemd[1]: Created slice system-systemd\x2dfsck.slice - Slice /system/systemd-fsck. Nov 1 00:15:39.760997 systemd[1]: Created slice user.slice - User and Session Slice. Nov 1 00:15:39.761009 systemd[1]: Started clevis-luks-askpass.path - Forward Password Requests to Clevis Directory Watch. Nov 1 00:15:39.761021 systemd[1]: Started systemd-ask-password-console.path - Dispatch Password Requests to Console Directory Watch. Nov 1 00:15:39.761034 systemd[1]: Started systemd-ask-password-wall.path - Forward Password Requests to Wall Directory Watch. Nov 1 00:15:39.761049 systemd[1]: Set up automount boot.automount - Boot partition Automount Point. Nov 1 00:15:39.761070 systemd[1]: Set up automount proc-sys-fs-binfmt_misc.automount - Arbitrary Executable File Formats File System Automount Point. Nov 1 00:15:39.761083 systemd[1]: Expecting device dev-disk-by\x2dlabel-OEM.device - /dev/disk/by-label/OEM... Nov 1 00:15:39.761095 systemd[1]: Expecting device dev-ttyS0.device - /dev/ttyS0... Nov 1 00:15:39.761107 systemd[1]: Reached target cryptsetup-pre.target - Local Encrypted Volumes (Pre). Nov 1 00:15:39.761119 systemd[1]: Stopped target initrd-switch-root.target - Switch Root. Nov 1 00:15:39.761131 systemd[1]: Stopped target initrd-fs.target - Initrd File Systems. Nov 1 00:15:39.761143 systemd[1]: Stopped target initrd-root-fs.target - Initrd Root File System. Nov 1 00:15:39.761159 systemd[1]: Reached target integritysetup.target - Local Integrity Protected Volumes. Nov 1 00:15:39.761171 systemd[1]: Reached target remote-cryptsetup.target - Remote Encrypted Volumes. Nov 1 00:15:39.761183 systemd[1]: Reached target remote-fs.target - Remote File Systems. Nov 1 00:15:39.761201 systemd[1]: Reached target slices.target - Slice Units. Nov 1 00:15:39.761213 systemd[1]: Reached target swap.target - Swaps. Nov 1 00:15:39.761225 systemd[1]: Reached target veritysetup.target - Local Verity Protected Volumes. Nov 1 00:15:39.761237 systemd[1]: Listening on systemd-coredump.socket - Process Core Dump Socket. Nov 1 00:15:39.761249 systemd[1]: Listening on systemd-networkd.socket - Network Service Netlink Socket. Nov 1 00:15:39.761264 systemd[1]: Listening on systemd-udevd-control.socket - udev Control Socket. Nov 1 00:15:39.761276 systemd[1]: Listening on systemd-udevd-kernel.socket - udev Kernel Socket. Nov 1 00:15:39.761288 systemd[1]: Listening on systemd-userdbd.socket - User Database Manager Socket. Nov 1 00:15:39.761300 systemd[1]: Mounting dev-hugepages.mount - Huge Pages File System... Nov 1 00:15:39.761313 systemd[1]: Mounting dev-mqueue.mount - POSIX Message Queue File System... Nov 1 00:15:39.761324 systemd[1]: Mounting media.mount - External Media Directory... Nov 1 00:15:39.761444 systemd[1]: proc-xen.mount - /proc/xen was skipped because of an unmet condition check (ConditionVirtualization=xen). Nov 1 00:15:39.761460 systemd[1]: Mounting sys-kernel-debug.mount - Kernel Debug File System... Nov 1 00:15:39.761478 systemd[1]: Mounting sys-kernel-tracing.mount - Kernel Trace File System... Nov 1 00:15:39.761495 systemd[1]: Mounting tmp.mount - Temporary Directory /tmp... Nov 1 00:15:39.761507 systemd[1]: var-lib-machines.mount - Virtual Machine and Container Storage (Compatibility) was skipped because of an unmet condition check (ConditionPathExists=/var/lib/machines.raw). Nov 1 00:15:39.761519 systemd[1]: Reached target machines.target - Containers. Nov 1 00:15:39.761531 systemd[1]: Starting flatcar-tmpfiles.service - Create missing system files... Nov 1 00:15:39.761544 systemd[1]: ignition-delete-config.service - Ignition (delete config) was skipped because no trigger condition checks were met. Nov 1 00:15:39.761556 systemd[1]: Starting kmod-static-nodes.service - Create List of Static Device Nodes... Nov 1 00:15:39.761568 systemd[1]: Starting modprobe@configfs.service - Load Kernel Module configfs... Nov 1 00:15:39.761580 systemd[1]: Starting modprobe@dm_mod.service - Load Kernel Module dm_mod... Nov 1 00:15:39.761595 systemd[1]: Starting modprobe@drm.service - Load Kernel Module drm... Nov 1 00:15:39.761607 systemd[1]: Starting modprobe@efi_pstore.service - Load Kernel Module efi_pstore... Nov 1 00:15:39.761619 systemd[1]: Starting modprobe@fuse.service - Load Kernel Module fuse... Nov 1 00:15:39.761631 systemd[1]: Starting modprobe@loop.service - Load Kernel Module loop... Nov 1 00:15:39.761643 systemd[1]: setup-nsswitch.service - Create /etc/nsswitch.conf was skipped because of an unmet condition check (ConditionPathExists=!/etc/nsswitch.conf). Nov 1 00:15:39.761655 systemd[1]: systemd-fsck-root.service: Deactivated successfully. Nov 1 00:15:39.761667 systemd[1]: Stopped systemd-fsck-root.service - File System Check on Root Device. Nov 1 00:15:39.761688 systemd[1]: systemd-fsck-usr.service: Deactivated successfully. Nov 1 00:15:39.761700 systemd[1]: Stopped systemd-fsck-usr.service. Nov 1 00:15:39.761715 systemd[1]: Starting systemd-journald.service - Journal Service... Nov 1 00:15:39.761736 kernel: loop: module loaded Nov 1 00:15:39.761761 systemd[1]: Starting systemd-modules-load.service - Load Kernel Modules... Nov 1 00:15:39.761774 kernel: fuse: init (API version 7.39) Nov 1 00:15:39.761786 systemd[1]: Starting systemd-network-generator.service - Generate network units from Kernel command line... Nov 1 00:15:39.761818 systemd-journald[1119]: Collecting audit messages is disabled. Nov 1 00:15:39.761840 kernel: ACPI: bus type drm_connector registered Nov 1 00:15:39.761852 systemd[1]: Starting systemd-remount-fs.service - Remount Root and Kernel File Systems... Nov 1 00:15:39.761869 systemd-journald[1119]: Journal started Nov 1 00:15:39.761890 systemd-journald[1119]: Runtime Journal (/run/log/journal/3778bbf071154c609150fbd9b9f65496) is 6.0M, max 48.3M, 42.2M free. Nov 1 00:15:39.326965 systemd[1]: Queued start job for default target multi-user.target. Nov 1 00:15:39.354075 systemd[1]: Unnecessary job was removed for dev-vda6.device - /dev/vda6. Nov 1 00:15:39.354764 systemd[1]: systemd-journald.service: Deactivated successfully. Nov 1 00:15:39.355299 systemd[1]: systemd-journald.service: Consumed 1.201s CPU time. Nov 1 00:15:39.767874 systemd[1]: Starting systemd-udev-trigger.service - Coldplug All udev Devices... Nov 1 00:15:39.818724 systemd[1]: verity-setup.service: Deactivated successfully. Nov 1 00:15:39.818832 systemd[1]: Stopped verity-setup.service. Nov 1 00:15:39.823780 systemd[1]: xenserver-pv-version.service - Set fake PV driver version for XenServer was skipped because of an unmet condition check (ConditionVirtualization=xen). Nov 1 00:15:39.828030 systemd[1]: Started systemd-journald.service - Journal Service. Nov 1 00:15:39.830026 systemd[1]: Mounted dev-hugepages.mount - Huge Pages File System. Nov 1 00:15:39.832374 systemd[1]: Mounted dev-mqueue.mount - POSIX Message Queue File System. Nov 1 00:15:39.834659 systemd[1]: Mounted media.mount - External Media Directory. Nov 1 00:15:39.836774 systemd[1]: Mounted sys-kernel-debug.mount - Kernel Debug File System. Nov 1 00:15:39.838842 systemd[1]: Mounted sys-kernel-tracing.mount - Kernel Trace File System. Nov 1 00:15:39.841027 systemd[1]: Mounted tmp.mount - Temporary Directory /tmp. Nov 1 00:15:39.843010 systemd[1]: Finished kmod-static-nodes.service - Create List of Static Device Nodes. Nov 1 00:15:39.845731 systemd[1]: modprobe@configfs.service: Deactivated successfully. Nov 1 00:15:39.845994 systemd[1]: Finished modprobe@configfs.service - Load Kernel Module configfs. Nov 1 00:15:39.848368 systemd[1]: modprobe@dm_mod.service: Deactivated successfully. Nov 1 00:15:39.848595 systemd[1]: Finished modprobe@dm_mod.service - Load Kernel Module dm_mod. Nov 1 00:15:39.851374 systemd[1]: modprobe@drm.service: Deactivated successfully. Nov 1 00:15:39.851640 systemd[1]: Finished modprobe@drm.service - Load Kernel Module drm. Nov 1 00:15:39.853912 systemd[1]: modprobe@efi_pstore.service: Deactivated successfully. Nov 1 00:15:39.854128 systemd[1]: Finished modprobe@efi_pstore.service - Load Kernel Module efi_pstore. Nov 1 00:15:39.856585 systemd[1]: modprobe@fuse.service: Deactivated successfully. Nov 1 00:15:39.856837 systemd[1]: Finished modprobe@fuse.service - Load Kernel Module fuse. Nov 1 00:15:39.859052 systemd[1]: modprobe@loop.service: Deactivated successfully. Nov 1 00:15:39.859257 systemd[1]: Finished modprobe@loop.service - Load Kernel Module loop. Nov 1 00:15:39.861725 systemd[1]: Finished systemd-modules-load.service - Load Kernel Modules. Nov 1 00:15:39.865508 systemd[1]: Finished systemd-network-generator.service - Generate network units from Kernel command line. Nov 1 00:15:39.868997 systemd[1]: Finished systemd-remount-fs.service - Remount Root and Kernel File Systems. Nov 1 00:15:39.886354 systemd[1]: Reached target network-pre.target - Preparation for Network. Nov 1 00:15:39.896963 systemd[1]: Mounting sys-fs-fuse-connections.mount - FUSE Control File System... Nov 1 00:15:39.900528 systemd[1]: Mounting sys-kernel-config.mount - Kernel Configuration File System... Nov 1 00:15:39.918463 systemd[1]: remount-root.service - Remount Root File System was skipped because of an unmet condition check (ConditionPathIsReadWrite=!/). Nov 1 00:15:39.918533 systemd[1]: Reached target local-fs.target - Local File Systems. Nov 1 00:15:39.922296 systemd[1]: Listening on systemd-sysext.socket - System Extension Image Management (Varlink). Nov 1 00:15:39.926433 systemd[1]: Starting dracut-shutdown.service - Restore /run/initramfs on shutdown... Nov 1 00:15:39.930163 systemd[1]: Starting ldconfig.service - Rebuild Dynamic Linker Cache... Nov 1 00:15:39.932582 systemd[1]: systemd-binfmt.service - Set Up Additional Binary Formats was skipped because no trigger condition checks were met. Nov 1 00:15:39.935118 systemd[1]: Starting systemd-hwdb-update.service - Rebuild Hardware Database... Nov 1 00:15:39.940964 systemd[1]: Starting systemd-journal-flush.service - Flush Journal to Persistent Storage... Nov 1 00:15:39.943698 systemd[1]: systemd-pstore.service - Platform Persistent Storage Archival was skipped because of an unmet condition check (ConditionDirectoryNotEmpty=/sys/fs/pstore). Nov 1 00:15:39.947598 systemd[1]: Starting systemd-random-seed.service - Load/Save OS Random Seed... Nov 1 00:15:39.955390 systemd-journald[1119]: Time spent on flushing to /var/log/journal/3778bbf071154c609150fbd9b9f65496 is 20.328ms for 977 entries. Nov 1 00:15:39.955390 systemd-journald[1119]: System Journal (/var/log/journal/3778bbf071154c609150fbd9b9f65496) is 8.0M, max 195.6M, 187.6M free. Nov 1 00:15:40.104500 systemd-journald[1119]: Received client request to flush runtime journal. Nov 1 00:15:40.104568 kernel: loop0: detected capacity change from 0 to 224512 Nov 1 00:15:40.104589 kernel: squashfs: version 4.0 (2009/01/31) Phillip Lougher Nov 1 00:15:40.104606 kernel: loop1: detected capacity change from 0 to 142488 Nov 1 00:15:39.954559 systemd[1]: systemd-repart.service - Repartition Root Disk was skipped because no trigger condition checks were met. Nov 1 00:15:39.957901 systemd[1]: Starting systemd-sysctl.service - Apply Kernel Variables... Nov 1 00:15:39.962128 systemd[1]: Starting systemd-sysext.service - Merge System Extension Images into /usr/ and /opt/... Nov 1 00:15:39.966000 systemd[1]: Starting systemd-tmpfiles-setup-dev-early.service - Create Static Device Nodes in /dev gracefully... Nov 1 00:15:39.971815 systemd[1]: Finished systemd-udev-trigger.service - Coldplug All udev Devices. Nov 1 00:15:39.974633 systemd[1]: Mounted sys-fs-fuse-connections.mount - FUSE Control File System. Nov 1 00:15:39.977181 systemd[1]: Mounted sys-kernel-config.mount - Kernel Configuration File System. Nov 1 00:15:39.981719 systemd[1]: Finished dracut-shutdown.service - Restore /run/initramfs on shutdown. Nov 1 00:15:39.995019 systemd[1]: Starting systemd-udev-settle.service - Wait for udev To Complete Device Initialization... Nov 1 00:15:40.017653 udevadm[1176]: systemd-udev-settle.service is deprecated. Please fix lvm2-activation-early.service, lvm2-activation.service not to pull it in. Nov 1 00:15:40.052576 systemd[1]: Finished systemd-sysctl.service - Apply Kernel Variables. Nov 1 00:15:40.052684 systemd-tmpfiles[1167]: ACLs are not supported, ignoring. Nov 1 00:15:40.052702 systemd-tmpfiles[1167]: ACLs are not supported, ignoring. Nov 1 00:15:40.061010 systemd[1]: Finished systemd-tmpfiles-setup-dev-early.service - Create Static Device Nodes in /dev gracefully. Nov 1 00:15:40.078275 systemd[1]: Finished flatcar-tmpfiles.service - Create missing system files. Nov 1 00:15:40.081006 systemd[1]: Finished systemd-random-seed.service - Load/Save OS Random Seed. Nov 1 00:15:40.084393 systemd[1]: Reached target first-boot-complete.target - First Boot Complete. Nov 1 00:15:40.105109 systemd[1]: Starting systemd-machine-id-commit.service - Commit a transient machine-id on disk... Nov 1 00:15:40.113589 systemd[1]: Starting systemd-sysusers.service - Create System Users... Nov 1 00:15:40.116582 systemd[1]: Finished systemd-journal-flush.service - Flush Journal to Persistent Storage. Nov 1 00:15:40.165786 kernel: loop2: detected capacity change from 0 to 140768 Nov 1 00:15:40.235347 systemd[1]: Finished systemd-sysusers.service - Create System Users. Nov 1 00:15:40.256227 systemd[1]: Starting systemd-tmpfiles-setup-dev.service - Create Static Device Nodes in /dev... Nov 1 00:15:40.258484 kernel: loop3: detected capacity change from 0 to 224512 Nov 1 00:15:40.282985 systemd-tmpfiles[1194]: ACLs are not supported, ignoring. Nov 1 00:15:40.283007 systemd-tmpfiles[1194]: ACLs are not supported, ignoring. Nov 1 00:15:40.289177 systemd[1]: Finished systemd-tmpfiles-setup-dev.service - Create Static Device Nodes in /dev. Nov 1 00:15:40.387956 kernel: loop4: detected capacity change from 0 to 142488 Nov 1 00:15:40.447778 kernel: loop5: detected capacity change from 0 to 140768 Nov 1 00:15:40.461854 (sd-merge)[1195]: Using extensions 'containerd-flatcar', 'docker-flatcar', 'kubernetes'. Nov 1 00:15:40.462602 (sd-merge)[1195]: Merged extensions into '/usr'. Nov 1 00:15:40.468865 systemd[1]: Reloading requested from client PID 1166 ('systemd-sysext') (unit systemd-sysext.service)... Nov 1 00:15:40.468881 systemd[1]: Reloading... Nov 1 00:15:40.626774 zram_generator::config[1223]: No configuration found. Nov 1 00:15:40.773912 ldconfig[1157]: /sbin/ldconfig: /lib/ld.so.conf is not an ELF file - it has the wrong magic bytes at the start. Nov 1 00:15:40.783199 systemd[1]: /usr/lib/systemd/system/docker.socket:6: ListenStream= references a path below legacy directory /var/run/, updating /var/run/docker.sock → /run/docker.sock; please update the unit file accordingly. Nov 1 00:15:40.847595 systemd[1]: etc-machine\x2did.mount: Deactivated successfully. Nov 1 00:15:40.848396 systemd[1]: Reloading finished in 378 ms. Nov 1 00:15:40.885874 systemd[1]: Finished ldconfig.service - Rebuild Dynamic Linker Cache. Nov 1 00:15:40.928297 systemd[1]: Finished systemd-sysext.service - Merge System Extension Images into /usr/ and /opt/. Nov 1 00:15:40.931330 systemd[1]: Finished systemd-machine-id-commit.service - Commit a transient machine-id on disk. Nov 1 00:15:40.977584 systemd[1]: Starting ensure-sysext.service... Nov 1 00:15:40.981331 systemd[1]: Starting systemd-tmpfiles-setup.service - Create System Files and Directories... Nov 1 00:15:40.991145 systemd[1]: Reloading requested from client PID 1262 ('systemctl') (unit ensure-sysext.service)... Nov 1 00:15:40.991159 systemd[1]: Reloading... Nov 1 00:15:41.091440 systemd-tmpfiles[1263]: /usr/lib/tmpfiles.d/provision.conf:20: Duplicate line for path "/root", ignoring. Nov 1 00:15:41.091917 systemd-tmpfiles[1263]: /usr/lib/tmpfiles.d/systemd-flatcar.conf:6: Duplicate line for path "/var/log/journal", ignoring. Nov 1 00:15:41.093082 systemd-tmpfiles[1263]: /usr/lib/tmpfiles.d/systemd.conf:29: Duplicate line for path "/var/lib/systemd", ignoring. Nov 1 00:15:41.093504 systemd-tmpfiles[1263]: ACLs are not supported, ignoring. Nov 1 00:15:41.093609 systemd-tmpfiles[1263]: ACLs are not supported, ignoring. Nov 1 00:15:41.094782 zram_generator::config[1316]: No configuration found. Nov 1 00:15:41.098850 systemd-tmpfiles[1263]: Detected autofs mount point /boot during canonicalization of boot. Nov 1 00:15:41.098968 systemd-tmpfiles[1263]: Skipping /boot Nov 1 00:15:41.113726 systemd-tmpfiles[1263]: Detected autofs mount point /boot during canonicalization of boot. Nov 1 00:15:41.113763 systemd-tmpfiles[1263]: Skipping /boot Nov 1 00:15:41.192200 systemd[1]: /usr/lib/systemd/system/docker.socket:6: ListenStream= references a path below legacy directory /var/run/, updating /var/run/docker.sock → /run/docker.sock; please update the unit file accordingly. Nov 1 00:15:41.248338 systemd[1]: Reloading finished in 256 ms. Nov 1 00:15:41.270285 systemd[1]: Finished systemd-hwdb-update.service - Rebuild Hardware Database. Nov 1 00:15:41.273402 systemd[1]: Finished systemd-tmpfiles-setup.service - Create System Files and Directories. Nov 1 00:15:41.298343 systemd[1]: Starting audit-rules.service - Load Security Auditing Rules... Nov 1 00:15:41.302778 systemd[1]: Starting clean-ca-certificates.service - Clean up broken links in /etc/ssl/certs... Nov 1 00:15:41.306862 systemd[1]: Starting systemd-journal-catalog-update.service - Rebuild Journal Catalog... Nov 1 00:15:41.313374 systemd[1]: Starting systemd-resolved.service - Network Name Resolution... Nov 1 00:15:41.320958 systemd[1]: Starting systemd-udevd.service - Rule-based Manager for Device Events and Files... Nov 1 00:15:41.325845 systemd[1]: Starting systemd-update-utmp.service - Record System Boot/Shutdown in UTMP... Nov 1 00:15:41.335191 systemd[1]: Starting systemd-userdbd.service - User Database Manager... Nov 1 00:15:41.339270 systemd[1]: proc-xen.mount - /proc/xen was skipped because of an unmet condition check (ConditionVirtualization=xen). Nov 1 00:15:41.339499 systemd[1]: ignition-delete-config.service - Ignition (delete config) was skipped because no trigger condition checks were met. Nov 1 00:15:41.350866 systemd[1]: Starting modprobe@dm_mod.service - Load Kernel Module dm_mod... Nov 1 00:15:41.354707 systemd[1]: Starting modprobe@efi_pstore.service - Load Kernel Module efi_pstore... Nov 1 00:15:41.358784 systemd[1]: Starting modprobe@loop.service - Load Kernel Module loop... Nov 1 00:15:41.360984 systemd[1]: systemd-binfmt.service - Set Up Additional Binary Formats was skipped because no trigger condition checks were met. Nov 1 00:15:41.361131 systemd[1]: xenserver-pv-version.service - Set fake PV driver version for XenServer was skipped because of an unmet condition check (ConditionVirtualization=xen). Nov 1 00:15:41.362352 systemd[1]: Finished systemd-journal-catalog-update.service - Rebuild Journal Catalog. Nov 1 00:15:41.365544 systemd[1]: modprobe@dm_mod.service: Deactivated successfully. Nov 1 00:15:41.365793 systemd[1]: Finished modprobe@dm_mod.service - Load Kernel Module dm_mod. Nov 1 00:15:41.382252 systemd[1]: proc-xen.mount - /proc/xen was skipped because of an unmet condition check (ConditionVirtualization=xen). Nov 1 00:15:41.382606 systemd[1]: ignition-delete-config.service - Ignition (delete config) was skipped because no trigger condition checks were met. Nov 1 00:15:41.384219 systemd-udevd[1333]: Using default interface naming scheme 'v255'. Nov 1 00:15:41.384720 systemd[1]: Starting modprobe@dm_mod.service - Load Kernel Module dm_mod... Nov 1 00:15:41.423460 systemd[1]: systemd-binfmt.service - Set Up Additional Binary Formats was skipped because no trigger condition checks were met. Nov 1 00:15:41.428309 augenrules[1356]: No rules Nov 1 00:15:41.428134 systemd[1]: Starting systemd-update-done.service - Update is Completed... Nov 1 00:15:41.430853 systemd[1]: xenserver-pv-version.service - Set fake PV driver version for XenServer was skipped because of an unmet condition check (ConditionVirtualization=xen). Nov 1 00:15:41.432173 systemd[1]: Finished audit-rules.service - Load Security Auditing Rules. Nov 1 00:15:41.435439 systemd[1]: Finished systemd-update-utmp.service - Record System Boot/Shutdown in UTMP. Nov 1 00:15:41.441211 systemd[1]: modprobe@efi_pstore.service: Deactivated successfully. Nov 1 00:15:41.441436 systemd[1]: Finished modprobe@efi_pstore.service - Load Kernel Module efi_pstore. Nov 1 00:15:41.444705 systemd[1]: Started systemd-userdbd.service - User Database Manager. Nov 1 00:15:41.448393 systemd[1]: modprobe@loop.service: Deactivated successfully. Nov 1 00:15:41.448672 systemd[1]: Finished modprobe@loop.service - Load Kernel Module loop. Nov 1 00:15:41.451682 systemd[1]: modprobe@dm_mod.service: Deactivated successfully. Nov 1 00:15:41.451970 systemd[1]: Finished modprobe@dm_mod.service - Load Kernel Module dm_mod. Nov 1 00:15:41.460441 systemd[1]: Finished systemd-update-done.service - Update is Completed. Nov 1 00:15:41.477413 systemd[1]: Started systemd-udevd.service - Rule-based Manager for Device Events and Files. Nov 1 00:15:41.498714 systemd[1]: Finished clean-ca-certificates.service - Clean up broken links in /etc/ssl/certs. Nov 1 00:15:41.513914 systemd[1]: Finished ensure-sysext.service. Nov 1 00:15:41.516538 systemd[1]: proc-xen.mount - /proc/xen was skipped because of an unmet condition check (ConditionVirtualization=xen). Nov 1 00:15:41.516715 systemd[1]: ignition-delete-config.service - Ignition (delete config) was skipped because no trigger condition checks were met. Nov 1 00:15:41.522955 systemd[1]: Starting modprobe@dm_mod.service - Load Kernel Module dm_mod... Nov 1 00:15:41.534058 systemd[1]: Starting modprobe@drm.service - Load Kernel Module drm... Nov 1 00:15:41.539949 systemd[1]: Starting modprobe@efi_pstore.service - Load Kernel Module efi_pstore... Nov 1 00:15:41.545959 systemd[1]: Starting modprobe@loop.service - Load Kernel Module loop... Nov 1 00:15:41.548072 systemd[1]: systemd-binfmt.service - Set Up Additional Binary Formats was skipped because no trigger condition checks were met. Nov 1 00:15:41.552457 systemd[1]: Starting systemd-networkd.service - Network Configuration... Nov 1 00:15:41.568017 systemd[1]: Starting systemd-timesyncd.service - Network Time Synchronization... Nov 1 00:15:41.570312 systemd[1]: update-ca-certificates.service - Update CA bundle at /etc/ssl/certs/ca-certificates.crt was skipped because of an unmet condition check (ConditionPathIsSymbolicLink=!/etc/ssl/certs/ca-certificates.crt). Nov 1 00:15:41.570351 systemd[1]: xenserver-pv-version.service - Set fake PV driver version for XenServer was skipped because of an unmet condition check (ConditionVirtualization=xen). Nov 1 00:15:41.571049 systemd[1]: modprobe@dm_mod.service: Deactivated successfully. Nov 1 00:15:41.571252 systemd[1]: Finished modprobe@dm_mod.service - Load Kernel Module dm_mod. Nov 1 00:15:41.573983 systemd[1]: modprobe@drm.service: Deactivated successfully. Nov 1 00:15:41.732367 kernel: BTRFS warning: duplicate device /dev/vda3 devid 1 generation 34 scanned by (udev-worker) (1383) Nov 1 00:15:41.733455 systemd[1]: Finished modprobe@drm.service - Load Kernel Module drm. Nov 1 00:15:41.737848 systemd[1]: modprobe@efi_pstore.service: Deactivated successfully. Nov 1 00:15:41.741525 systemd[1]: Finished modprobe@efi_pstore.service - Load Kernel Module efi_pstore. Nov 1 00:15:41.744392 systemd[1]: modprobe@loop.service: Deactivated successfully. Nov 1 00:15:41.744630 systemd[1]: Finished modprobe@loop.service - Load Kernel Module loop. Nov 1 00:15:41.758860 systemd[1]: Condition check resulted in dev-ttyS0.device - /dev/ttyS0 being skipped. Nov 1 00:15:41.767299 systemd-resolved[1332]: Positive Trust Anchors: Nov 1 00:15:41.767606 systemd-resolved[1332]: . IN DS 20326 8 2 e06d44b80b8f1d39a95c0b0d7c65d08458e880409bbc683457104237c7f8ec8d Nov 1 00:15:41.767694 systemd-resolved[1332]: Negative trust anchors: home.arpa 10.in-addr.arpa 16.172.in-addr.arpa 17.172.in-addr.arpa 18.172.in-addr.arpa 19.172.in-addr.arpa 20.172.in-addr.arpa 21.172.in-addr.arpa 22.172.in-addr.arpa 23.172.in-addr.arpa 24.172.in-addr.arpa 25.172.in-addr.arpa 26.172.in-addr.arpa 27.172.in-addr.arpa 28.172.in-addr.arpa 29.172.in-addr.arpa 30.172.in-addr.arpa 31.172.in-addr.arpa 170.0.0.192.in-addr.arpa 171.0.0.192.in-addr.arpa 168.192.in-addr.arpa d.f.ip6.arpa ipv4only.arpa resolver.arpa corp home internal intranet lan local private test Nov 1 00:15:41.773220 systemd-resolved[1332]: Defaulting to hostname 'linux'. Nov 1 00:15:41.777950 systemd[1]: Started systemd-resolved.service - Network Name Resolution. Nov 1 00:15:41.787351 systemd[1]: Reached target nss-lookup.target - Host and Network Name Lookups. Nov 1 00:15:41.792073 systemd[1]: systemd-pstore.service - Platform Persistent Storage Archival was skipped because of an unmet condition check (ConditionDirectoryNotEmpty=/sys/fs/pstore). Nov 1 00:15:41.792173 systemd[1]: systemd-repart.service - Repartition Root Disk was skipped because no trigger condition checks were met. Nov 1 00:15:41.837910 systemd[1]: Found device dev-disk-by\x2dlabel-OEM.device - /dev/disk/by-label/OEM. Nov 1 00:15:41.842121 kernel: input: Power Button as /devices/LNXSYSTM:00/LNXPWRBN:00/input/input2 Nov 1 00:15:41.980791 kernel: ACPI: button: Power Button [PWRF] Nov 1 00:15:41.988117 systemd[1]: Starting systemd-fsck@dev-disk-by\x2dlabel-OEM.service - File System Check on /dev/disk/by-label/OEM... Nov 1 00:15:41.995149 systemd[1]: Started systemd-timesyncd.service - Network Time Synchronization. Nov 1 00:15:41.997896 systemd[1]: Reached target time-set.target - System Time Set. Nov 1 00:15:42.004489 systemd-networkd[1401]: lo: Link UP Nov 1 00:15:42.004505 systemd-networkd[1401]: lo: Gained carrier Nov 1 00:15:42.007172 systemd-networkd[1401]: Enumeration completed Nov 1 00:15:42.007297 systemd[1]: Started systemd-networkd.service - Network Configuration. Nov 1 00:15:42.007656 systemd-networkd[1401]: eth0: found matching network '/usr/lib/systemd/network/zz-default.network', based on potentially unpredictable interface name. Nov 1 00:15:42.007666 systemd-networkd[1401]: eth0: Configuring with /usr/lib/systemd/network/zz-default.network. Nov 1 00:15:42.007685 systemd[1]: Reached target network.target - Network. Nov 1 00:15:42.010712 systemd-networkd[1401]: eth0: Link UP Nov 1 00:15:42.010723 systemd-networkd[1401]: eth0: Gained carrier Nov 1 00:15:42.010751 systemd-networkd[1401]: eth0: found matching network '/usr/lib/systemd/network/zz-default.network', based on potentially unpredictable interface name. Nov 1 00:15:42.019231 systemd[1]: Starting systemd-networkd-wait-online.service - Wait for Network to be Configured... Nov 1 00:15:42.021546 kernel: i801_smbus 0000:00:1f.3: Enabling SMBus device Nov 1 00:15:42.023363 kernel: i801_smbus 0000:00:1f.3: SMBus using PCI interrupt Nov 1 00:15:42.023541 kernel: i2c i2c-0: 1/1 memory slots populated (from DMI) Nov 1 00:15:42.023789 kernel: i2c i2c-0: Memory type 0x07 not supported yet, not instantiating SPD Nov 1 00:15:42.037449 kernel: input: ImExPS/2 Generic Explorer Mouse as /devices/platform/i8042/serio1/input/input3 Nov 1 00:15:42.035965 systemd-networkd[1401]: eth0: DHCPv4 address 10.0.0.42/16, gateway 10.0.0.1 acquired from 10.0.0.1 Nov 1 00:15:42.037343 systemd-timesyncd[1403]: Network configuration changed, trying to establish connection. Nov 1 00:15:42.041132 systemd[1]: Starting systemd-vconsole-setup.service - Virtual Console Setup... Nov 1 00:15:42.726269 systemd-timesyncd[1403]: Contacted time server 10.0.0.1:123 (10.0.0.1). Nov 1 00:15:42.726350 systemd-timesyncd[1403]: Initial clock synchronization to Sat 2025-11-01 00:15:42.726104 UTC. Nov 1 00:15:42.726416 systemd-resolved[1332]: Clock change detected. Flushing caches. Nov 1 00:15:42.728089 systemd[1]: Finished systemd-fsck@dev-disk-by\x2dlabel-OEM.service - File System Check on /dev/disk/by-label/OEM. Nov 1 00:15:42.732845 kernel: mousedev: PS/2 mouse device common for all mice Nov 1 00:15:42.811066 systemd[1]: systemd-vconsole-setup.service: Deactivated successfully. Nov 1 00:15:42.811425 systemd[1]: Stopped systemd-vconsole-setup.service - Virtual Console Setup. Nov 1 00:15:42.828023 systemd[1]: Starting systemd-vconsole-setup.service - Virtual Console Setup... Nov 1 00:15:42.914104 kernel: kvm_amd: TSC scaling supported Nov 1 00:15:42.914176 kernel: kvm_amd: Nested Virtualization enabled Nov 1 00:15:42.914219 kernel: kvm_amd: Nested Paging enabled Nov 1 00:15:42.916406 kernel: kvm_amd: LBR virtualization supported Nov 1 00:15:42.916468 kernel: kvm_amd: Virtual VMLOAD VMSAVE supported Nov 1 00:15:42.917460 kernel: kvm_amd: Virtual GIF supported Nov 1 00:15:42.940845 kernel: EDAC MC: Ver: 3.0.0 Nov 1 00:15:42.953295 systemd[1]: Finished systemd-vconsole-setup.service - Virtual Console Setup. Nov 1 00:15:42.980579 systemd[1]: Finished systemd-udev-settle.service - Wait for udev To Complete Device Initialization. Nov 1 00:15:42.996032 systemd[1]: Starting lvm2-activation-early.service - Activation of LVM2 logical volumes... Nov 1 00:15:43.010152 lvm[1433]: WARNING: Failed to connect to lvmetad. Falling back to device scanning. Nov 1 00:15:43.043075 systemd[1]: Finished lvm2-activation-early.service - Activation of LVM2 logical volumes. Nov 1 00:15:43.046317 systemd[1]: Reached target cryptsetup.target - Local Encrypted Volumes. Nov 1 00:15:43.048717 systemd[1]: Reached target sysinit.target - System Initialization. Nov 1 00:15:43.051308 systemd[1]: Started motdgen.path - Watch for update engine configuration changes. Nov 1 00:15:43.054345 systemd[1]: Started user-cloudinit@var-lib-flatcar\x2dinstall-user_data.path - Watch for a cloud-config at /var/lib/flatcar-install/user_data. Nov 1 00:15:43.057377 systemd[1]: Started logrotate.timer - Daily rotation of log files. Nov 1 00:15:43.059822 systemd[1]: Started mdadm.timer - Weekly check for MD array's redundancy information.. Nov 1 00:15:43.062467 systemd[1]: Started systemd-tmpfiles-clean.timer - Daily Cleanup of Temporary Directories. Nov 1 00:15:43.065245 systemd[1]: update-engine-stub.timer - Update Engine Stub Timer was skipped because of an unmet condition check (ConditionPathExists=/usr/.noupdate). Nov 1 00:15:43.065300 systemd[1]: Reached target paths.target - Path Units. Nov 1 00:15:43.067082 systemd[1]: Reached target timers.target - Timer Units. Nov 1 00:15:43.069598 systemd[1]: Listening on dbus.socket - D-Bus System Message Bus Socket. Nov 1 00:15:43.073618 systemd[1]: Starting docker.socket - Docker Socket for the API... Nov 1 00:15:43.090300 systemd[1]: Listening on sshd.socket - OpenSSH Server Socket. Nov 1 00:15:43.095541 systemd[1]: Starting lvm2-activation.service - Activation of LVM2 logical volumes... Nov 1 00:15:43.098594 systemd[1]: Listening on docker.socket - Docker Socket for the API. Nov 1 00:15:43.101082 systemd[1]: Reached target sockets.target - Socket Units. Nov 1 00:15:43.103059 systemd[1]: Reached target basic.target - Basic System. Nov 1 00:15:43.105017 systemd[1]: addon-config@oem.service - Configure Addon /oem was skipped because no trigger condition checks were met. Nov 1 00:15:43.105062 systemd[1]: addon-run@oem.service - Run Addon /oem was skipped because no trigger condition checks were met. Nov 1 00:15:43.106832 systemd[1]: Starting containerd.service - containerd container runtime... Nov 1 00:15:43.112837 lvm[1437]: WARNING: Failed to connect to lvmetad. Falling back to device scanning. Nov 1 00:15:43.110507 systemd[1]: Starting dbus.service - D-Bus System Message Bus... Nov 1 00:15:43.115934 systemd[1]: Starting enable-oem-cloudinit.service - Enable cloudinit... Nov 1 00:15:43.121130 systemd[1]: Starting extend-filesystems.service - Extend Filesystems... Nov 1 00:15:43.123288 systemd[1]: flatcar-setup-environment.service - Modifies /etc/environment for CoreOS was skipped because of an unmet condition check (ConditionPathExists=/oem/bin/flatcar-setup-environment). Nov 1 00:15:43.124924 systemd[1]: Starting motdgen.service - Generate /run/flatcar/motd... Nov 1 00:15:43.128503 systemd[1]: Starting ssh-key-proc-cmdline.service - Install an ssh key from /proc/cmdline... Nov 1 00:15:43.130445 jq[1440]: false Nov 1 00:15:43.133992 systemd[1]: Starting sshd-keygen.service - Generate sshd host keys... Nov 1 00:15:43.145079 systemd[1]: Starting systemd-logind.service - User Login Management... Nov 1 00:15:43.148022 systemd[1]: tcsd.service - TCG Core Services Daemon was skipped because of an unmet condition check (ConditionPathExists=/dev/tpm0). Nov 1 00:15:43.148739 systemd[1]: cgroup compatibility translation between legacy and unified hierarchy settings activated. See cgroup-compat debug messages for details. Nov 1 00:15:43.152758 extend-filesystems[1441]: Found loop3 Nov 1 00:15:43.154576 extend-filesystems[1441]: Found loop4 Nov 1 00:15:43.154576 extend-filesystems[1441]: Found loop5 Nov 1 00:15:43.154576 extend-filesystems[1441]: Found sr0 Nov 1 00:15:43.154576 extend-filesystems[1441]: Found vda Nov 1 00:15:43.154576 extend-filesystems[1441]: Found vda1 Nov 1 00:15:43.154576 extend-filesystems[1441]: Found vda2 Nov 1 00:15:43.154576 extend-filesystems[1441]: Found vda3 Nov 1 00:15:43.154576 extend-filesystems[1441]: Found usr Nov 1 00:15:43.154576 extend-filesystems[1441]: Found vda4 Nov 1 00:15:43.154576 extend-filesystems[1441]: Found vda6 Nov 1 00:15:43.154576 extend-filesystems[1441]: Found vda7 Nov 1 00:15:43.154576 extend-filesystems[1441]: Found vda9 Nov 1 00:15:43.154576 extend-filesystems[1441]: Checking size of /dev/vda9 Nov 1 00:15:43.155021 systemd[1]: Starting update-engine.service - Update Engine... Nov 1 00:15:43.170325 dbus-daemon[1439]: [system] SELinux support is enabled Nov 1 00:15:43.209401 extend-filesystems[1441]: Resized partition /dev/vda9 Nov 1 00:15:43.174078 systemd[1]: Starting update-ssh-keys-after-ignition.service - Run update-ssh-keys once after Ignition... Nov 1 00:15:43.178270 systemd[1]: Started dbus.service - D-Bus System Message Bus. Nov 1 00:15:43.193214 systemd[1]: Finished lvm2-activation.service - Activation of LVM2 logical volumes. Nov 1 00:15:43.218746 extend-filesystems[1462]: resize2fs 1.47.1 (20-May-2024) Nov 1 00:15:43.227921 kernel: BTRFS warning: duplicate device /dev/vda3 devid 1 generation 34 scanned by (udev-worker) (1381) Nov 1 00:15:43.227957 update_engine[1448]: I20251101 00:15:43.227514 1448 main.cc:92] Flatcar Update Engine starting Nov 1 00:15:43.220321 systemd[1]: enable-oem-cloudinit.service: Skipped due to 'exec-condition'. Nov 1 00:15:43.220596 systemd[1]: Condition check resulted in enable-oem-cloudinit.service - Enable cloudinit being skipped. Nov 1 00:15:43.221031 systemd[1]: motdgen.service: Deactivated successfully. Nov 1 00:15:43.221270 systemd[1]: Finished motdgen.service - Generate /run/flatcar/motd. Nov 1 00:15:43.229376 systemd[1]: ssh-key-proc-cmdline.service: Deactivated successfully. Nov 1 00:15:43.229632 systemd[1]: Finished ssh-key-proc-cmdline.service - Install an ssh key from /proc/cmdline. Nov 1 00:15:43.231879 update_engine[1448]: I20251101 00:15:43.231762 1448 update_check_scheduler.cc:74] Next update check in 4m59s Nov 1 00:15:43.241784 systemd[1]: Started update-engine.service - Update Engine. Nov 1 00:15:43.243044 jq[1457]: true Nov 1 00:15:43.249645 systemd[1]: system-cloudinit@usr-share-oem-cloud\x2dconfig.yml.service - Load cloud-config from /usr/share/oem/cloud-config.yml was skipped because of an unmet condition check (ConditionFileNotEmpty=/usr/share/oem/cloud-config.yml). Nov 1 00:15:43.249693 systemd[1]: Reached target system-config.target - Load system-provided cloud configs. Nov 1 00:15:43.258269 systemd[1]: user-cloudinit-proc-cmdline.service - Load cloud-config from url defined in /proc/cmdline was skipped because of an unmet condition check (ConditionKernelCommandLine=cloud-config-url). Nov 1 00:15:43.258299 systemd[1]: Reached target user-config.target - Load user-provided cloud configs. Nov 1 00:15:43.259103 (ntainerd)[1472]: containerd.service: Referenced but unset environment variable evaluates to an empty string: TORCX_IMAGEDIR, TORCX_UNPACKDIR Nov 1 00:15:43.261786 jq[1470]: true Nov 1 00:15:43.262346 systemd[1]: Started locksmithd.service - Cluster reboot manager. Nov 1 00:15:43.310849 kernel: EXT4-fs (vda9): resizing filesystem from 553472 to 1864699 blocks Nov 1 00:15:43.425338 systemd-logind[1446]: Watching system buttons on /dev/input/event1 (Power Button) Nov 1 00:15:43.425388 systemd-logind[1446]: Watching system buttons on /dev/input/event0 (AT Translated Set 2 keyboard) Nov 1 00:15:43.450444 systemd-logind[1446]: New seat seat0. Nov 1 00:15:43.451292 sshd_keygen[1458]: ssh-keygen: generating new host keys: RSA ECDSA ED25519 Nov 1 00:15:43.453336 systemd[1]: Started systemd-logind.service - User Login Management. Nov 1 00:15:43.463559 locksmithd[1474]: locksmithd starting currentOperation="UPDATE_STATUS_IDLE" strategy="reboot" Nov 1 00:15:43.486416 systemd[1]: Finished sshd-keygen.service - Generate sshd host keys. Nov 1 00:15:43.505331 systemd[1]: Starting issuegen.service - Generate /run/issue... Nov 1 00:15:43.515396 systemd[1]: issuegen.service: Deactivated successfully. Nov 1 00:15:43.515682 systemd[1]: Finished issuegen.service - Generate /run/issue. Nov 1 00:15:43.519600 systemd[1]: Starting systemd-user-sessions.service - Permit User Sessions... Nov 1 00:15:43.617057 kernel: EXT4-fs (vda9): resized filesystem to 1864699 Nov 1 00:15:43.634825 systemd[1]: Finished systemd-user-sessions.service - Permit User Sessions. Nov 1 00:15:43.654326 systemd[1]: Started getty@tty1.service - Getty on tty1. Nov 1 00:15:43.657958 systemd[1]: Started serial-getty@ttyS0.service - Serial Getty on ttyS0. Nov 1 00:15:43.660184 systemd[1]: Reached target getty.target - Login Prompts. Nov 1 00:15:43.785455 extend-filesystems[1462]: Filesystem at /dev/vda9 is mounted on /; on-line resizing required Nov 1 00:15:43.785455 extend-filesystems[1462]: old_desc_blocks = 1, new_desc_blocks = 1 Nov 1 00:15:43.785455 extend-filesystems[1462]: The filesystem on /dev/vda9 is now 1864699 (4k) blocks long. Nov 1 00:15:43.792017 extend-filesystems[1441]: Resized filesystem in /dev/vda9 Nov 1 00:15:43.795536 systemd[1]: extend-filesystems.service: Deactivated successfully. Nov 1 00:15:43.795875 systemd[1]: Finished extend-filesystems.service - Extend Filesystems. Nov 1 00:15:43.798256 bash[1490]: Updated "/home/core/.ssh/authorized_keys" Nov 1 00:15:43.799411 systemd[1]: Finished update-ssh-keys-after-ignition.service - Run update-ssh-keys once after Ignition. Nov 1 00:15:43.803696 systemd[1]: sshkeys.service was skipped because no trigger condition checks were met. Nov 1 00:15:44.148933 containerd[1472]: time="2025-11-01T00:15:44.148625400Z" level=info msg="starting containerd" revision=174e0d1785eeda18dc2beba45e1d5a188771636b version=v1.7.21 Nov 1 00:15:44.181232 containerd[1472]: time="2025-11-01T00:15:44.181147129Z" level=info msg="loading plugin \"io.containerd.snapshotter.v1.aufs\"..." type=io.containerd.snapshotter.v1 Nov 1 00:15:44.183915 containerd[1472]: time="2025-11-01T00:15:44.183859444Z" 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.113-flatcar\\n\"): skip plugin" type=io.containerd.snapshotter.v1 Nov 1 00:15:44.183915 containerd[1472]: time="2025-11-01T00:15:44.183889330Z" level=info msg="loading plugin \"io.containerd.event.v1.exchange\"..." type=io.containerd.event.v1 Nov 1 00:15:44.183915 containerd[1472]: time="2025-11-01T00:15:44.183909708Z" level=info msg="loading plugin \"io.containerd.internal.v1.opt\"..." type=io.containerd.internal.v1 Nov 1 00:15:44.184276 containerd[1472]: time="2025-11-01T00:15:44.184239096Z" level=info msg="loading plugin \"io.containerd.warning.v1.deprecations\"..." type=io.containerd.warning.v1 Nov 1 00:15:44.184276 containerd[1472]: time="2025-11-01T00:15:44.184263422Z" level=info msg="loading plugin \"io.containerd.snapshotter.v1.blockfile\"..." type=io.containerd.snapshotter.v1 Nov 1 00:15:44.184390 containerd[1472]: time="2025-11-01T00:15:44.184358159Z" level=info msg="skip loading plugin \"io.containerd.snapshotter.v1.blockfile\"..." error="no scratch file generator: skip plugin" type=io.containerd.snapshotter.v1 Nov 1 00:15:44.184390 containerd[1472]: time="2025-11-01T00:15:44.184375532Z" level=info msg="loading plugin \"io.containerd.snapshotter.v1.btrfs\"..." type=io.containerd.snapshotter.v1 Nov 1 00:15:44.184655 containerd[1472]: time="2025-11-01T00:15:44.184611815Z" level=info msg="skip loading plugin \"io.containerd.snapshotter.v1.btrfs\"..." error="path /var/lib/containerd/io.containerd.snapshotter.v1.btrfs (ext4) must be a btrfs filesystem to be used with the btrfs snapshotter: skip plugin" type=io.containerd.snapshotter.v1 Nov 1 00:15:44.184655 containerd[1472]: time="2025-11-01T00:15:44.184644035Z" level=info msg="loading plugin \"io.containerd.snapshotter.v1.devmapper\"..." type=io.containerd.snapshotter.v1 Nov 1 00:15:44.184705 containerd[1472]: time="2025-11-01T00:15:44.184658903Z" level=info msg="skip loading plugin \"io.containerd.snapshotter.v1.devmapper\"..." error="devmapper not configured: skip plugin" type=io.containerd.snapshotter.v1 Nov 1 00:15:44.184705 containerd[1472]: time="2025-11-01T00:15:44.184671427Z" level=info msg="loading plugin \"io.containerd.snapshotter.v1.native\"..." type=io.containerd.snapshotter.v1 Nov 1 00:15:44.184820 containerd[1472]: time="2025-11-01T00:15:44.184784869Z" level=info msg="loading plugin \"io.containerd.snapshotter.v1.overlayfs\"..." type=io.containerd.snapshotter.v1 Nov 1 00:15:44.185123 containerd[1472]: time="2025-11-01T00:15:44.185088769Z" level=info msg="loading plugin \"io.containerd.snapshotter.v1.zfs\"..." type=io.containerd.snapshotter.v1 Nov 1 00:15:44.185262 containerd[1472]: time="2025-11-01T00:15:44.185229944Z" level=info msg="skip loading plugin \"io.containerd.snapshotter.v1.zfs\"..." error="path /var/lib/containerd/io.containerd.snapshotter.v1.zfs must be a zfs filesystem to be used with the zfs snapshotter: skip plugin" type=io.containerd.snapshotter.v1 Nov 1 00:15:44.185262 containerd[1472]: time="2025-11-01T00:15:44.185248058Z" level=info msg="loading plugin \"io.containerd.content.v1.content\"..." type=io.containerd.content.v1 Nov 1 00:15:44.185394 containerd[1472]: time="2025-11-01T00:15:44.185362693Z" level=info msg="loading plugin \"io.containerd.metadata.v1.bolt\"..." type=io.containerd.metadata.v1 Nov 1 00:15:44.185459 containerd[1472]: time="2025-11-01T00:15:44.185436010Z" level=info msg="metadata content store policy set" policy=shared Nov 1 00:15:44.279908 containerd[1472]: time="2025-11-01T00:15:44.279753265Z" level=info msg="loading plugin \"io.containerd.gc.v1.scheduler\"..." type=io.containerd.gc.v1 Nov 1 00:15:44.279908 containerd[1472]: time="2025-11-01T00:15:44.279898177Z" level=info msg="loading plugin \"io.containerd.differ.v1.walking\"..." type=io.containerd.differ.v1 Nov 1 00:15:44.279908 containerd[1472]: time="2025-11-01T00:15:44.279922603Z" level=info msg="loading plugin \"io.containerd.lease.v1.manager\"..." type=io.containerd.lease.v1 Nov 1 00:15:44.280191 containerd[1472]: time="2025-11-01T00:15:44.279941688Z" level=info msg="loading plugin \"io.containerd.streaming.v1.manager\"..." type=io.containerd.streaming.v1 Nov 1 00:15:44.280191 containerd[1472]: time="2025-11-01T00:15:44.279959832Z" level=info msg="loading plugin \"io.containerd.runtime.v1.linux\"..." type=io.containerd.runtime.v1 Nov 1 00:15:44.280242 containerd[1472]: time="2025-11-01T00:15:44.280201385Z" level=info msg="loading plugin \"io.containerd.monitor.v1.cgroups\"..." type=io.containerd.monitor.v1 Nov 1 00:15:44.280648 containerd[1472]: time="2025-11-01T00:15:44.280571068Z" level=info msg="loading plugin \"io.containerd.runtime.v2.task\"..." type=io.containerd.runtime.v2 Nov 1 00:15:44.280779 containerd[1472]: time="2025-11-01T00:15:44.280762066Z" level=info msg="loading plugin \"io.containerd.runtime.v2.shim\"..." type=io.containerd.runtime.v2 Nov 1 00:15:44.280839 containerd[1472]: time="2025-11-01T00:15:44.280779680Z" level=info msg="loading plugin \"io.containerd.sandbox.store.v1.local\"..." type=io.containerd.sandbox.store.v1 Nov 1 00:15:44.280839 containerd[1472]: time="2025-11-01T00:15:44.280824323Z" level=info msg="loading plugin \"io.containerd.sandbox.controller.v1.local\"..." type=io.containerd.sandbox.controller.v1 Nov 1 00:15:44.280896 containerd[1472]: time="2025-11-01T00:15:44.280842898Z" level=info msg="loading plugin \"io.containerd.service.v1.containers-service\"..." type=io.containerd.service.v1 Nov 1 00:15:44.280896 containerd[1472]: time="2025-11-01T00:15:44.280865260Z" level=info msg="loading plugin \"io.containerd.service.v1.content-service\"..." type=io.containerd.service.v1 Nov 1 00:15:44.280896 containerd[1472]: time="2025-11-01T00:15:44.280881420Z" level=info msg="loading plugin \"io.containerd.service.v1.diff-service\"..." type=io.containerd.service.v1 Nov 1 00:15:44.281067 containerd[1472]: time="2025-11-01T00:15:44.280898833Z" level=info msg="loading plugin \"io.containerd.service.v1.images-service\"..." type=io.containerd.service.v1 Nov 1 00:15:44.281067 containerd[1472]: time="2025-11-01T00:15:44.280918079Z" level=info msg="loading plugin \"io.containerd.service.v1.introspection-service\"..." type=io.containerd.service.v1 Nov 1 00:15:44.281067 containerd[1472]: time="2025-11-01T00:15:44.280931003Z" level=info msg="loading plugin \"io.containerd.service.v1.namespaces-service\"..." type=io.containerd.service.v1 Nov 1 00:15:44.281067 containerd[1472]: time="2025-11-01T00:15:44.280949398Z" level=info msg="loading plugin \"io.containerd.service.v1.snapshots-service\"..." type=io.containerd.service.v1 Nov 1 00:15:44.281067 containerd[1472]: time="2025-11-01T00:15:44.280964767Z" level=info msg="loading plugin \"io.containerd.service.v1.tasks-service\"..." type=io.containerd.service.v1 Nov 1 00:15:44.281067 containerd[1472]: time="2025-11-01T00:15:44.280992108Z" level=info msg="loading plugin \"io.containerd.grpc.v1.containers\"..." type=io.containerd.grpc.v1 Nov 1 00:15:44.281067 containerd[1472]: time="2025-11-01T00:15:44.281005934Z" level=info msg="loading plugin \"io.containerd.grpc.v1.content\"..." type=io.containerd.grpc.v1 Nov 1 00:15:44.281067 containerd[1472]: time="2025-11-01T00:15:44.281018147Z" level=info msg="loading plugin \"io.containerd.grpc.v1.diff\"..." type=io.containerd.grpc.v1 Nov 1 00:15:44.281067 containerd[1472]: time="2025-11-01T00:15:44.281031652Z" level=info msg="loading plugin \"io.containerd.grpc.v1.events\"..." type=io.containerd.grpc.v1 Nov 1 00:15:44.281067 containerd[1472]: time="2025-11-01T00:15:44.281046319Z" level=info msg="loading plugin \"io.containerd.grpc.v1.images\"..." type=io.containerd.grpc.v1 Nov 1 00:15:44.281067 containerd[1472]: time="2025-11-01T00:15:44.281060917Z" level=info msg="loading plugin \"io.containerd.grpc.v1.introspection\"..." type=io.containerd.grpc.v1 Nov 1 00:15:44.281280 containerd[1472]: time="2025-11-01T00:15:44.281077869Z" level=info msg="loading plugin \"io.containerd.grpc.v1.leases\"..." type=io.containerd.grpc.v1 Nov 1 00:15:44.281280 containerd[1472]: time="2025-11-01T00:15:44.281092566Z" level=info msg="loading plugin \"io.containerd.grpc.v1.namespaces\"..." type=io.containerd.grpc.v1 Nov 1 00:15:44.281280 containerd[1472]: time="2025-11-01T00:15:44.281104468Z" level=info msg="loading plugin \"io.containerd.grpc.v1.sandbox-controllers\"..." type=io.containerd.grpc.v1 Nov 1 00:15:44.281280 containerd[1472]: time="2025-11-01T00:15:44.281131920Z" level=info msg="loading plugin \"io.containerd.grpc.v1.sandboxes\"..." type=io.containerd.grpc.v1 Nov 1 00:15:44.281280 containerd[1472]: time="2025-11-01T00:15:44.281145385Z" level=info msg="loading plugin \"io.containerd.grpc.v1.snapshots\"..." type=io.containerd.grpc.v1 Nov 1 00:15:44.281280 containerd[1472]: time="2025-11-01T00:15:44.281163970Z" level=info msg="loading plugin \"io.containerd.grpc.v1.streaming\"..." type=io.containerd.grpc.v1 Nov 1 00:15:44.281280 containerd[1472]: time="2025-11-01T00:15:44.281181393Z" level=info msg="loading plugin \"io.containerd.grpc.v1.tasks\"..." type=io.containerd.grpc.v1 Nov 1 00:15:44.281280 containerd[1472]: time="2025-11-01T00:15:44.281206570Z" level=info msg="loading plugin \"io.containerd.transfer.v1.local\"..." type=io.containerd.transfer.v1 Nov 1 00:15:44.281280 containerd[1472]: time="2025-11-01T00:15:44.281260221Z" level=info msg="loading plugin \"io.containerd.grpc.v1.transfer\"..." type=io.containerd.grpc.v1 Nov 1 00:15:44.281280 containerd[1472]: time="2025-11-01T00:15:44.281274768Z" level=info msg="loading plugin \"io.containerd.grpc.v1.version\"..." type=io.containerd.grpc.v1 Nov 1 00:15:44.281448 containerd[1472]: time="2025-11-01T00:15:44.281291068Z" level=info msg="loading plugin \"io.containerd.internal.v1.restart\"..." type=io.containerd.internal.v1 Nov 1 00:15:44.281448 containerd[1472]: time="2025-11-01T00:15:44.281367241Z" level=info msg="loading plugin \"io.containerd.tracing.processor.v1.otlp\"..." type=io.containerd.tracing.processor.v1 Nov 1 00:15:44.281448 containerd[1472]: time="2025-11-01T00:15:44.281392448Z" level=info msg="skip loading plugin \"io.containerd.tracing.processor.v1.otlp\"..." error="skip plugin: tracing endpoint not configured" type=io.containerd.tracing.processor.v1 Nov 1 00:15:44.281448 containerd[1472]: time="2025-11-01T00:15:44.281404561Z" level=info msg="loading plugin \"io.containerd.internal.v1.tracing\"..." type=io.containerd.internal.v1 Nov 1 00:15:44.281448 containerd[1472]: time="2025-11-01T00:15:44.281415852Z" level=info msg="skip loading plugin \"io.containerd.internal.v1.tracing\"..." error="skip plugin: tracing endpoint not configured" type=io.containerd.internal.v1 Nov 1 00:15:44.281448 containerd[1472]: time="2025-11-01T00:15:44.281425621Z" level=info msg="loading plugin \"io.containerd.grpc.v1.healthcheck\"..." type=io.containerd.grpc.v1 Nov 1 00:15:44.281448 containerd[1472]: time="2025-11-01T00:15:44.281442182Z" level=info msg="loading plugin \"io.containerd.nri.v1.nri\"..." type=io.containerd.nri.v1 Nov 1 00:15:44.281571 containerd[1472]: time="2025-11-01T00:15:44.281471156Z" level=info msg="NRI interface is disabled by configuration." Nov 1 00:15:44.281571 containerd[1472]: time="2025-11-01T00:15:44.281506572Z" level=info msg="loading plugin \"io.containerd.grpc.v1.cri\"..." type=io.containerd.grpc.v1 Nov 1 00:15:44.282000 containerd[1472]: time="2025-11-01T00:15:44.281918795Z" level=info msg="Start cri plugin with config {PluginConfig:{ContainerdConfig:{Snapshotter:overlayfs DefaultRuntimeName:runc DefaultRuntime:{Type: Path: Engine: PodAnnotations:[] ContainerAnnotations:[] Root: Options:map[] PrivilegedWithoutHostDevices:false PrivilegedWithoutHostDevicesAllDevicesAllowed:false BaseRuntimeSpec: NetworkPluginConfDir: NetworkPluginMaxConfNum:0 Snapshotter: SandboxMode:} UntrustedWorkloadRuntime:{Type: Path: Engine: PodAnnotations:[] ContainerAnnotations:[] Root: Options:map[] PrivilegedWithoutHostDevices:false PrivilegedWithoutHostDevicesAllDevicesAllowed:false BaseRuntimeSpec: NetworkPluginConfDir: NetworkPluginMaxConfNum:0 Snapshotter: SandboxMode:} Runtimes:map[runc:{Type:io.containerd.runc.v2 Path: Engine: PodAnnotations:[] ContainerAnnotations:[] Root: Options:map[SystemdCgroup:true] PrivilegedWithoutHostDevices:false PrivilegedWithoutHostDevicesAllDevicesAllowed:false BaseRuntimeSpec: NetworkPluginConfDir: NetworkPluginMaxConfNum:0 Snapshotter: SandboxMode:podsandbox}] NoPivot:false DisableSnapshotAnnotations:true DiscardUnpackedLayers:false IgnoreBlockIONotEnabledErrors:false IgnoreRdtNotEnabledErrors:false} CniConfig:{NetworkPluginBinDir:/opt/cni/bin NetworkPluginConfDir:/etc/cni/net.d NetworkPluginMaxConfNum:1 NetworkPluginSetupSerially:false NetworkPluginConfTemplate: IPPreference:} Registry:{ConfigPath: Mirrors:map[] Configs:map[] Auths:map[] Headers:map[]} ImageDecryption:{KeyModel:node} DisableTCPService:true StreamServerAddress:127.0.0.1 StreamServerPort:0 StreamIdleTimeout:4h0m0s EnableSelinux:true SelinuxCategoryRange:1024 SandboxImage:registry.k8s.io/pause:3.8 StatsCollectPeriod:10 SystemdCgroup:false EnableTLSStreaming:false X509KeyPairStreaming:{TLSCertFile: TLSKeyFile:} MaxContainerLogLineSize:16384 DisableCgroup:false DisableApparmor:false RestrictOOMScoreAdj:false MaxConcurrentDownloads:3 DisableProcMount:false UnsetSeccompProfile: TolerateMissingHugetlbController:true DisableHugetlbController:true DeviceOwnershipFromSecurityContext:false IgnoreImageDefinedVolumes:false NetNSMountsUnderStateDir:false EnableUnprivilegedPorts:false EnableUnprivilegedICMP:false EnableCDI:false CDISpecDirs:[/etc/cdi /var/run/cdi] ImagePullProgressTimeout:5m0s DrainExecSyncIOTimeout:0s ImagePullWithSyncFs:false IgnoreDeprecationWarnings:[]} ContainerdRootDir:/var/lib/containerd ContainerdEndpoint:/run/containerd/containerd.sock RootDir:/var/lib/containerd/io.containerd.grpc.v1.cri StateDir:/run/containerd/io.containerd.grpc.v1.cri}" Nov 1 00:15:44.282000 containerd[1472]: time="2025-11-01T00:15:44.281985681Z" level=info msg="Connect containerd service" Nov 1 00:15:44.282229 containerd[1472]: time="2025-11-01T00:15:44.282028721Z" level=info msg="using legacy CRI server" Nov 1 00:15:44.282229 containerd[1472]: time="2025-11-01T00:15:44.282035795Z" level=info msg="using experimental NRI integration - disable nri plugin to prevent this" Nov 1 00:15:44.282229 containerd[1472]: time="2025-11-01T00:15:44.282184884Z" level=info msg="Get image filesystem path \"/var/lib/containerd/io.containerd.snapshotter.v1.overlayfs\"" Nov 1 00:15:44.282991 containerd[1472]: time="2025-11-01T00:15:44.282952193Z" level=error msg="failed to load cni during init, please check CRI plugin status before setting up network for pods" error="cni config load failed: no network config found in /etc/cni/net.d: cni plugin not initialized: failed to load cni config" Nov 1 00:15:44.283282 containerd[1472]: time="2025-11-01T00:15:44.283177576Z" level=info msg="Start subscribing containerd event" Nov 1 00:15:44.283320 containerd[1472]: time="2025-11-01T00:15:44.283309894Z" level=info msg="Start recovering state" Nov 1 00:15:44.283453 containerd[1472]: time="2025-11-01T00:15:44.283423717Z" level=info msg=serving... address=/run/containerd/containerd.sock.ttrpc Nov 1 00:15:44.283453 containerd[1472]: time="2025-11-01T00:15:44.283438675Z" level=info msg="Start event monitor" Nov 1 00:15:44.283500 containerd[1472]: time="2025-11-01T00:15:44.283466688Z" level=info msg="Start snapshots syncer" Nov 1 00:15:44.283500 containerd[1472]: time="2025-11-01T00:15:44.283487857Z" level=info msg="Start cni network conf syncer for default" Nov 1 00:15:44.283542 containerd[1472]: time="2025-11-01T00:15:44.283501523Z" level=info msg=serving... address=/run/containerd/containerd.sock Nov 1 00:15:44.283565 containerd[1472]: time="2025-11-01T00:15:44.283548381Z" level=info msg="Start streaming server" Nov 1 00:15:44.283915 systemd[1]: Started containerd.service - containerd container runtime. Nov 1 00:15:44.285840 containerd[1472]: time="2025-11-01T00:15:44.284487492Z" level=info msg="containerd successfully booted in 0.139644s" Nov 1 00:15:44.513068 systemd-networkd[1401]: eth0: Gained IPv6LL Nov 1 00:15:44.517779 systemd[1]: Finished systemd-networkd-wait-online.service - Wait for Network to be Configured. Nov 1 00:15:44.521047 systemd[1]: Reached target network-online.target - Network is Online. Nov 1 00:15:44.533134 systemd[1]: Starting coreos-metadata.service - QEMU metadata agent... Nov 1 00:15:44.536485 systemd[1]: Starting kubelet.service - kubelet: The Kubernetes Node Agent... Nov 1 00:15:44.539754 systemd[1]: Starting nvidia.service - NVIDIA Configure Service... Nov 1 00:15:44.585554 systemd[1]: coreos-metadata.service: Deactivated successfully. Nov 1 00:15:44.586010 systemd[1]: Finished coreos-metadata.service - QEMU metadata agent. Nov 1 00:15:44.588722 systemd[1]: packet-phone-home.service - Report Success to Packet was skipped because no trigger condition checks were met. Nov 1 00:15:44.589402 systemd[1]: Finished nvidia.service - NVIDIA Configure Service. Nov 1 00:15:45.300042 systemd[1]: Created slice system-sshd.slice - Slice /system/sshd. Nov 1 00:15:45.303721 systemd[1]: Started sshd@0-10.0.0.42:22-10.0.0.1:48818.service - OpenSSH per-connection server daemon (10.0.0.1:48818). Nov 1 00:15:45.381942 sshd[1541]: Accepted publickey for core from 10.0.0.1 port 48818 ssh2: RSA SHA256:jhdmrhZXRbwOcBbBZQf03C3Vb9eSOfvUjDz7MOKA8jE Nov 1 00:15:45.385210 sshd[1541]: pam_unix(sshd:session): session opened for user core(uid=500) by core(uid=0) Nov 1 00:15:45.397228 systemd-logind[1446]: New session 1 of user core. Nov 1 00:15:45.398763 systemd[1]: Created slice user-500.slice - User Slice of UID 500. Nov 1 00:15:45.414307 systemd[1]: Starting user-runtime-dir@500.service - User Runtime Directory /run/user/500... Nov 1 00:15:45.438142 systemd[1]: Finished user-runtime-dir@500.service - User Runtime Directory /run/user/500. Nov 1 00:15:45.469818 systemd[1]: Starting user@500.service - User Manager for UID 500... Nov 1 00:15:45.476426 (systemd)[1545]: pam_unix(systemd-user:session): session opened for user core(uid=500) by (uid=0) Nov 1 00:15:45.665891 systemd[1545]: Queued start job for default target default.target. Nov 1 00:15:45.677631 systemd[1545]: Created slice app.slice - User Application Slice. Nov 1 00:15:45.677669 systemd[1545]: Reached target paths.target - Paths. Nov 1 00:15:45.677690 systemd[1545]: Reached target timers.target - Timers. Nov 1 00:15:45.681066 systemd[1545]: Starting dbus.socket - D-Bus User Message Bus Socket... Nov 1 00:15:45.700214 systemd[1545]: Listening on dbus.socket - D-Bus User Message Bus Socket. Nov 1 00:15:45.700434 systemd[1545]: Reached target sockets.target - Sockets. Nov 1 00:15:45.700459 systemd[1545]: Reached target basic.target - Basic System. Nov 1 00:15:45.700515 systemd[1545]: Reached target default.target - Main User Target. Nov 1 00:15:45.700561 systemd[1545]: Startup finished in 211ms. Nov 1 00:15:45.700876 systemd[1]: Started user@500.service - User Manager for UID 500. Nov 1 00:15:45.713000 systemd[1]: Started session-1.scope - Session 1 of User core. Nov 1 00:15:45.853232 systemd[1]: Started sshd@1-10.0.0.42:22-10.0.0.1:48834.service - OpenSSH per-connection server daemon (10.0.0.1:48834). Nov 1 00:15:45.913074 sshd[1556]: Accepted publickey for core from 10.0.0.1 port 48834 ssh2: RSA SHA256:jhdmrhZXRbwOcBbBZQf03C3Vb9eSOfvUjDz7MOKA8jE Nov 1 00:15:45.916635 sshd[1556]: pam_unix(sshd:session): session opened for user core(uid=500) by core(uid=0) Nov 1 00:15:45.922308 systemd-logind[1446]: New session 2 of user core. Nov 1 00:15:45.934175 systemd[1]: Started session-2.scope - Session 2 of User core. Nov 1 00:15:46.000775 sshd[1556]: pam_unix(sshd:session): session closed for user core Nov 1 00:15:46.009021 systemd[1]: sshd@1-10.0.0.42:22-10.0.0.1:48834.service: Deactivated successfully. Nov 1 00:15:46.011176 systemd[1]: session-2.scope: Deactivated successfully. Nov 1 00:15:46.013462 systemd-logind[1446]: Session 2 logged out. Waiting for processes to exit. Nov 1 00:15:46.014916 systemd[1]: Started sshd@2-10.0.0.42:22-10.0.0.1:48842.service - OpenSSH per-connection server daemon (10.0.0.1:48842). Nov 1 00:15:46.018627 systemd-logind[1446]: Removed session 2. Nov 1 00:15:46.086658 sshd[1563]: Accepted publickey for core from 10.0.0.1 port 48842 ssh2: RSA SHA256:jhdmrhZXRbwOcBbBZQf03C3Vb9eSOfvUjDz7MOKA8jE Nov 1 00:15:46.089284 sshd[1563]: pam_unix(sshd:session): session opened for user core(uid=500) by core(uid=0) Nov 1 00:15:46.090597 systemd[1]: Started kubelet.service - kubelet: The Kubernetes Node Agent. Nov 1 00:15:46.093438 systemd[1]: Reached target multi-user.target - Multi-User System. Nov 1 00:15:46.095842 systemd[1]: Startup finished in 1.396s (kernel) + 7.891s (initrd) + 6.798s (userspace) = 16.087s. Nov 1 00:15:46.099716 (kubelet)[1570]: kubelet.service: Referenced but unset environment variable evaluates to an empty string: KUBELET_EXTRA_ARGS, KUBELET_KUBEADM_ARGS Nov 1 00:15:46.102330 systemd-logind[1446]: New session 3 of user core. Nov 1 00:15:46.105754 systemd[1]: Started session-3.scope - Session 3 of User core. Nov 1 00:15:46.168290 sshd[1563]: pam_unix(sshd:session): session closed for user core Nov 1 00:15:46.173085 systemd[1]: sshd@2-10.0.0.42:22-10.0.0.1:48842.service: Deactivated successfully. Nov 1 00:15:46.175139 systemd[1]: session-3.scope: Deactivated successfully. Nov 1 00:15:46.175857 systemd-logind[1446]: Session 3 logged out. Waiting for processes to exit. Nov 1 00:15:46.177337 systemd-logind[1446]: Removed session 3. Nov 1 00:15:46.877384 kubelet[1570]: E1101 00:15:46.877285 1570 run.go:72] "command failed" err="failed to load kubelet config file, path: /var/lib/kubelet/config.yaml, error: failed to load Kubelet config file /var/lib/kubelet/config.yaml, error failed to read kubelet config file \"/var/lib/kubelet/config.yaml\", error: open /var/lib/kubelet/config.yaml: no such file or directory" Nov 1 00:15:46.881732 systemd[1]: kubelet.service: Main process exited, code=exited, status=1/FAILURE Nov 1 00:15:46.881981 systemd[1]: kubelet.service: Failed with result 'exit-code'. Nov 1 00:15:46.882372 systemd[1]: kubelet.service: Consumed 2.083s CPU time. Nov 1 00:15:56.195267 systemd[1]: Started sshd@3-10.0.0.42:22-10.0.0.1:59208.service - OpenSSH per-connection server daemon (10.0.0.1:59208). Nov 1 00:15:56.230121 sshd[1587]: Accepted publickey for core from 10.0.0.1 port 59208 ssh2: RSA SHA256:jhdmrhZXRbwOcBbBZQf03C3Vb9eSOfvUjDz7MOKA8jE Nov 1 00:15:56.232489 sshd[1587]: pam_unix(sshd:session): session opened for user core(uid=500) by core(uid=0) Nov 1 00:15:56.237907 systemd-logind[1446]: New session 4 of user core. Nov 1 00:15:56.248038 systemd[1]: Started session-4.scope - Session 4 of User core. Nov 1 00:15:56.308343 sshd[1587]: pam_unix(sshd:session): session closed for user core Nov 1 00:15:56.316395 systemd[1]: sshd@3-10.0.0.42:22-10.0.0.1:59208.service: Deactivated successfully. Nov 1 00:15:56.318643 systemd[1]: session-4.scope: Deactivated successfully. Nov 1 00:15:56.321247 systemd-logind[1446]: Session 4 logged out. Waiting for processes to exit. Nov 1 00:15:56.333246 systemd[1]: Started sshd@4-10.0.0.42:22-10.0.0.1:59218.service - OpenSSH per-connection server daemon (10.0.0.1:59218). Nov 1 00:15:56.334887 systemd-logind[1446]: Removed session 4. Nov 1 00:15:56.367488 sshd[1594]: Accepted publickey for core from 10.0.0.1 port 59218 ssh2: RSA SHA256:jhdmrhZXRbwOcBbBZQf03C3Vb9eSOfvUjDz7MOKA8jE Nov 1 00:15:56.369760 sshd[1594]: pam_unix(sshd:session): session opened for user core(uid=500) by core(uid=0) Nov 1 00:15:56.375500 systemd-logind[1446]: New session 5 of user core. Nov 1 00:15:56.386075 systemd[1]: Started session-5.scope - Session 5 of User core. Nov 1 00:15:56.437961 sshd[1594]: pam_unix(sshd:session): session closed for user core Nov 1 00:15:56.458105 systemd[1]: sshd@4-10.0.0.42:22-10.0.0.1:59218.service: Deactivated successfully. Nov 1 00:15:56.460438 systemd[1]: session-5.scope: Deactivated successfully. Nov 1 00:15:56.462255 systemd-logind[1446]: Session 5 logged out. Waiting for processes to exit. Nov 1 00:15:56.475172 systemd[1]: Started sshd@5-10.0.0.42:22-10.0.0.1:59224.service - OpenSSH per-connection server daemon (10.0.0.1:59224). Nov 1 00:15:56.476570 systemd-logind[1446]: Removed session 5. Nov 1 00:15:56.507767 sshd[1601]: Accepted publickey for core from 10.0.0.1 port 59224 ssh2: RSA SHA256:jhdmrhZXRbwOcBbBZQf03C3Vb9eSOfvUjDz7MOKA8jE Nov 1 00:15:56.509710 sshd[1601]: pam_unix(sshd:session): session opened for user core(uid=500) by core(uid=0) Nov 1 00:15:56.514040 systemd-logind[1446]: New session 6 of user core. Nov 1 00:15:56.523936 systemd[1]: Started session-6.scope - Session 6 of User core. Nov 1 00:15:56.581784 sshd[1601]: pam_unix(sshd:session): session closed for user core Nov 1 00:15:56.598183 systemd[1]: sshd@5-10.0.0.42:22-10.0.0.1:59224.service: Deactivated successfully. Nov 1 00:15:56.600344 systemd[1]: session-6.scope: Deactivated successfully. Nov 1 00:15:56.601883 systemd-logind[1446]: Session 6 logged out. Waiting for processes to exit. Nov 1 00:15:56.611105 systemd[1]: Started sshd@6-10.0.0.42:22-10.0.0.1:59232.service - OpenSSH per-connection server daemon (10.0.0.1:59232). Nov 1 00:15:56.612263 systemd-logind[1446]: Removed session 6. Nov 1 00:15:56.643087 sshd[1608]: Accepted publickey for core from 10.0.0.1 port 59232 ssh2: RSA SHA256:jhdmrhZXRbwOcBbBZQf03C3Vb9eSOfvUjDz7MOKA8jE Nov 1 00:15:56.644935 sshd[1608]: pam_unix(sshd:session): session opened for user core(uid=500) by core(uid=0) Nov 1 00:15:56.649430 systemd-logind[1446]: New session 7 of user core. Nov 1 00:15:56.658991 systemd[1]: Started session-7.scope - Session 7 of User core. Nov 1 00:15:56.720396 sudo[1611]: core : PWD=/home/core ; USER=root ; COMMAND=/home/core/install.sh Nov 1 00:15:56.720764 sudo[1611]: pam_unix(sudo:session): session opened for user root(uid=0) by core(uid=500) Nov 1 00:15:56.747217 systemd[1]: Starting coreos-metadata.service - QEMU metadata agent... Nov 1 00:15:56.772256 systemd[1]: coreos-metadata.service: Deactivated successfully. Nov 1 00:15:56.772525 systemd[1]: Finished coreos-metadata.service - QEMU metadata agent. Nov 1 00:15:57.132484 systemd[1]: kubelet.service: Scheduled restart job, restart counter is at 1. Nov 1 00:15:57.142152 systemd[1]: Starting kubelet.service - kubelet: The Kubernetes Node Agent... Nov 1 00:15:57.403489 systemd[1]: Started kubelet.service - kubelet: The Kubernetes Node Agent. Nov 1 00:15:57.413724 (kubelet)[1653]: kubelet.service: Referenced but unset environment variable evaluates to an empty string: KUBELET_EXTRA_ARGS, KUBELET_KUBEADM_ARGS Nov 1 00:15:57.420360 systemd[1]: Stopping kubelet.service - kubelet: The Kubernetes Node Agent... Nov 1 00:15:57.422744 systemd[1]: kubelet.service: Deactivated successfully. Nov 1 00:15:57.423173 systemd[1]: Stopped kubelet.service - kubelet: The Kubernetes Node Agent. Nov 1 00:15:57.436099 systemd[1]: Starting kubelet.service - kubelet: The Kubernetes Node Agent... Nov 1 00:15:57.461843 systemd[1]: Reloading requested from client PID 1667 ('systemctl') (unit session-7.scope)... Nov 1 00:15:57.461866 systemd[1]: Reloading... Nov 1 00:15:57.559879 zram_generator::config[1705]: No configuration found. Nov 1 00:15:58.518907 systemd[1]: /usr/lib/systemd/system/docker.socket:6: ListenStream= references a path below legacy directory /var/run/, updating /var/run/docker.sock → /run/docker.sock; please update the unit file accordingly. Nov 1 00:15:58.616403 systemd[1]: Reloading finished in 1154 ms. Nov 1 00:15:58.686909 systemd[1]: Stopping kubelet.service - kubelet: The Kubernetes Node Agent... Nov 1 00:15:58.691984 systemd[1]: kubelet.service: Deactivated successfully. Nov 1 00:15:58.692422 systemd[1]: Stopped kubelet.service - kubelet: The Kubernetes Node Agent. Nov 1 00:15:58.709535 systemd[1]: Starting kubelet.service - kubelet: The Kubernetes Node Agent... Nov 1 00:15:58.943759 systemd[1]: Started kubelet.service - kubelet: The Kubernetes Node Agent. Nov 1 00:15:58.952090 (kubelet)[1755]: kubelet.service: Referenced but unset environment variable evaluates to an empty string: KUBELET_EXTRA_ARGS Nov 1 00:15:59.012551 kubelet[1755]: Flag --container-runtime-endpoint has been deprecated, This parameter should be set via the config file specified by the Kubelet's --config flag. See https://kubernetes.io/docs/tasks/administer-cluster/kubelet-config-file/ for more information. Nov 1 00:15:59.012551 kubelet[1755]: Flag --pod-infra-container-image has been deprecated, will be removed in 1.35. Image garbage collector will get sandbox image information from CRI. Nov 1 00:15:59.012551 kubelet[1755]: Flag --volume-plugin-dir has been deprecated, This parameter should be set via the config file specified by the Kubelet's --config flag. See https://kubernetes.io/docs/tasks/administer-cluster/kubelet-config-file/ for more information. Nov 1 00:15:59.012551 kubelet[1755]: I1101 00:15:59.011399 1755 server.go:215] "--pod-infra-container-image will not be pruned by the image garbage collector in kubelet and should also be set in the remote runtime" Nov 1 00:15:59.295449 kubelet[1755]: I1101 00:15:59.295297 1755 server.go:520] "Kubelet version" kubeletVersion="v1.32.4" Nov 1 00:15:59.295449 kubelet[1755]: I1101 00:15:59.295337 1755 server.go:522] "Golang settings" GOGC="" GOMAXPROCS="" GOTRACEBACK="" Nov 1 00:15:59.295718 kubelet[1755]: I1101 00:15:59.295689 1755 server.go:954] "Client rotation is on, will bootstrap in background" Nov 1 00:15:59.327677 kubelet[1755]: I1101 00:15:59.325558 1755 dynamic_cafile_content.go:161] "Starting controller" name="client-ca-bundle::/etc/kubernetes/pki/ca.crt" Nov 1 00:15:59.341352 kubelet[1755]: E1101 00:15:59.341259 1755 log.go:32] "RuntimeConfig from runtime service failed" err="rpc error: code = Unimplemented desc = unknown method RuntimeConfig for service runtime.v1.RuntimeService" Nov 1 00:15:59.341352 kubelet[1755]: I1101 00:15:59.341333 1755 server.go:1421] "CRI implementation should be updated to support RuntimeConfig when KubeletCgroupDriverFromCRI feature gate has been enabled. Falling back to using cgroupDriver from kubelet config." Nov 1 00:15:59.349982 kubelet[1755]: I1101 00:15:59.349926 1755 server.go:772] "--cgroups-per-qos enabled, but --cgroup-root was not specified. defaulting to /" Nov 1 00:15:59.350549 kubelet[1755]: I1101 00:15:59.350419 1755 container_manager_linux.go:268] "Container manager verified user specified cgroup-root exists" cgroupRoot=[] Nov 1 00:15:59.350825 kubelet[1755]: I1101 00:15:59.350529 1755 container_manager_linux.go:273] "Creating Container Manager object based on Node Config" nodeConfig={"NodeName":"10.0.0.42","RuntimeCgroupsName":"","SystemCgroupsName":"","KubeletCgroupsName":"","KubeletOOMScoreAdj":-999,"ContainerRuntime":"","CgroupsPerQOS":true,"CgroupRoot":"/","CgroupDriver":"systemd","KubeletRootDir":"/var/lib/kubelet","ProtectKernelDefaults":false,"KubeReservedCgroupName":"","SystemReservedCgroupName":"","ReservedSystemCPUs":{},"EnforceNodeAllocatable":{"pods":{}},"KubeReserved":null,"SystemReserved":null,"HardEvictionThresholds":[{"Signal":"memory.available","Operator":"LessThan","Value":{"Quantity":"100Mi","Percentage":0},"GracePeriod":0,"MinReclaim":null},{"Signal":"nodefs.available","Operator":"LessThan","Value":{"Quantity":null,"Percentage":0.1},"GracePeriod":0,"MinReclaim":null},{"Signal":"nodefs.inodesFree","Operator":"LessThan","Value":{"Quantity":null,"Percentage":0.05},"GracePeriod":0,"MinReclaim":null},{"Signal":"imagefs.available","Operator":"LessThan","Value":{"Quantity":null,"Percentage":0.15},"GracePeriod":0,"MinReclaim":null},{"Signal":"imagefs.inodesFree","Operator":"LessThan","Value":{"Quantity":null,"Percentage":0.05},"GracePeriod":0,"MinReclaim":null}],"QOSReserved":{},"CPUManagerPolicy":"none","CPUManagerPolicyOptions":null,"TopologyManagerScope":"container","CPUManagerReconcilePeriod":10000000000,"ExperimentalMemoryManagerPolicy":"None","ExperimentalMemoryManagerReservedMemory":null,"PodPidsLimit":-1,"EnforceCPULimits":true,"CPUCFSQuotaPeriod":100000000,"TopologyManagerPolicy":"none","TopologyManagerPolicyOptions":null,"CgroupVersion":2} Nov 1 00:15:59.352052 kubelet[1755]: I1101 00:15:59.352006 1755 topology_manager.go:138] "Creating topology manager with none policy" Nov 1 00:15:59.352052 kubelet[1755]: I1101 00:15:59.352033 1755 container_manager_linux.go:304] "Creating device plugin manager" Nov 1 00:15:59.352317 kubelet[1755]: I1101 00:15:59.352284 1755 state_mem.go:36] "Initialized new in-memory state store" Nov 1 00:15:59.357779 kubelet[1755]: I1101 00:15:59.357737 1755 kubelet.go:446] "Attempting to sync node with API server" Nov 1 00:15:59.357779 kubelet[1755]: I1101 00:15:59.357783 1755 kubelet.go:341] "Adding static pod path" path="/etc/kubernetes/manifests" Nov 1 00:15:59.357935 kubelet[1755]: I1101 00:15:59.357841 1755 kubelet.go:352] "Adding apiserver pod source" Nov 1 00:15:59.357935 kubelet[1755]: I1101 00:15:59.357865 1755 apiserver.go:42] "Waiting for node sync before watching apiserver pods" Nov 1 00:15:59.358594 kubelet[1755]: E1101 00:15:59.358023 1755 file.go:98] "Unable to read config path" err="path does not exist, ignoring" path="/etc/kubernetes/manifests" Nov 1 00:15:59.358594 kubelet[1755]: E1101 00:15:59.358040 1755 file_linux.go:61] "Unable to read config path" err="path does not exist, ignoring" path="/etc/kubernetes/manifests" Nov 1 00:15:59.361174 kubelet[1755]: I1101 00:15:59.361140 1755 kuberuntime_manager.go:269] "Container runtime initialized" containerRuntime="containerd" version="v1.7.21" apiVersion="v1" Nov 1 00:15:59.361700 kubelet[1755]: I1101 00:15:59.361675 1755 kubelet.go:890] "Not starting ClusterTrustBundle informer because we are in static kubelet mode" Nov 1 00:15:59.361777 kubelet[1755]: W1101 00:15:59.361765 1755 probe.go:272] Flexvolume plugin directory at /opt/libexec/kubernetes/kubelet-plugins/volume/exec/ does not exist. Recreating. Nov 1 00:15:59.364451 kubelet[1755]: I1101 00:15:59.364426 1755 watchdog_linux.go:99] "Systemd watchdog is not enabled" Nov 1 00:15:59.364496 kubelet[1755]: I1101 00:15:59.364475 1755 server.go:1287] "Started kubelet" Nov 1 00:15:59.367232 kubelet[1755]: I1101 00:15:59.367180 1755 fs_resource_analyzer.go:67] "Starting FS ResourceAnalyzer" Nov 1 00:15:59.370572 kubelet[1755]: I1101 00:15:59.370345 1755 volume_manager.go:297] "Starting Kubelet Volume Manager" Nov 1 00:15:59.370572 kubelet[1755]: I1101 00:15:59.370431 1755 desired_state_of_world_populator.go:150] "Desired state populator starts to run" Nov 1 00:15:59.370572 kubelet[1755]: I1101 00:15:59.370493 1755 reconciler.go:26] "Reconciler: start to sync state" Nov 1 00:15:59.371541 kubelet[1755]: I1101 00:15:59.371371 1755 server.go:169] "Starting to listen" address="0.0.0.0" port=10250 Nov 1 00:15:59.372774 kubelet[1755]: I1101 00:15:59.372741 1755 server.go:479] "Adding debug handlers to kubelet server" Nov 1 00:15:59.374791 kubelet[1755]: I1101 00:15:59.374580 1755 ratelimit.go:55] "Setting rate limiting for endpoint" service="podresources" qps=100 burstTokens=10 Nov 1 00:15:59.375045 kubelet[1755]: I1101 00:15:59.375011 1755 server.go:243] "Starting to serve the podresources API" endpoint="unix:/var/lib/kubelet/pod-resources/kubelet.sock" Nov 1 00:15:59.375276 kubelet[1755]: E1101 00:15:59.375240 1755 kubelet.go:1555] "Image garbage collection failed once. Stats initialization may not have completed yet" err="invalid capacity 0 on image filesystem" Nov 1 00:15:59.375338 kubelet[1755]: I1101 00:15:59.375278 1755 dynamic_serving_content.go:135] "Starting controller" name="kubelet-server-cert-files::/var/lib/kubelet/pki/kubelet.crt::/var/lib/kubelet/pki/kubelet.key" Nov 1 00:15:59.375661 kubelet[1755]: E1101 00:15:59.375389 1755 kubelet_node_status.go:466] "Error getting the current node from lister" err="node \"10.0.0.42\" not found" Nov 1 00:15:59.376151 kubelet[1755]: I1101 00:15:59.376129 1755 factory.go:221] Registration of the containerd container factory successfully Nov 1 00:15:59.376151 kubelet[1755]: I1101 00:15:59.376146 1755 factory.go:221] Registration of the systemd container factory successfully Nov 1 00:15:59.376277 kubelet[1755]: I1101 00:15:59.376261 1755 factory.go:219] Registration of the crio container factory failed: Get "http://%2Fvar%2Frun%2Fcrio%2Fcrio.sock/info": dial unix /var/run/crio/crio.sock: connect: no such file or directory Nov 1 00:15:59.379886 kubelet[1755]: E1101 00:15:59.379439 1755 nodelease.go:49] "Failed to get node when trying to set owner ref to the node lease" err="nodes \"10.0.0.42\" not found" node="10.0.0.42" Nov 1 00:15:59.392602 kubelet[1755]: I1101 00:15:59.392556 1755 cpu_manager.go:221] "Starting CPU manager" policy="none" Nov 1 00:15:59.392602 kubelet[1755]: I1101 00:15:59.392573 1755 cpu_manager.go:222] "Reconciling" reconcilePeriod="10s" Nov 1 00:15:59.392602 kubelet[1755]: I1101 00:15:59.392596 1755 state_mem.go:36] "Initialized new in-memory state store" Nov 1 00:15:59.476250 kubelet[1755]: E1101 00:15:59.476168 1755 kubelet_node_status.go:466] "Error getting the current node from lister" err="node \"10.0.0.42\" not found" Nov 1 00:15:59.577333 kubelet[1755]: E1101 00:15:59.577081 1755 kubelet_node_status.go:466] "Error getting the current node from lister" err="node \"10.0.0.42\" not found" Nov 1 00:15:59.678257 kubelet[1755]: E1101 00:15:59.678136 1755 kubelet_node_status.go:466] "Error getting the current node from lister" err="node \"10.0.0.42\" not found" Nov 1 00:15:59.733070 kubelet[1755]: E1101 00:15:59.733018 1755 csi_plugin.go:308] Failed to initialize CSINode: error updating CSINode annotation: timed out waiting for the condition; caused by: nodes "10.0.0.42" not found Nov 1 00:15:59.778951 kubelet[1755]: E1101 00:15:59.778859 1755 kubelet_node_status.go:466] "Error getting the current node from lister" err="node \"10.0.0.42\" not found" Nov 1 00:15:59.800381 kubelet[1755]: I1101 00:15:59.800318 1755 policy_none.go:49] "None policy: Start" Nov 1 00:15:59.800381 kubelet[1755]: I1101 00:15:59.800370 1755 memory_manager.go:186] "Starting memorymanager" policy="None" Nov 1 00:15:59.800532 kubelet[1755]: I1101 00:15:59.800406 1755 state_mem.go:35] "Initializing new in-memory state store" Nov 1 00:15:59.813710 systemd[1]: Created slice kubepods.slice - libcontainer container kubepods.slice. Nov 1 00:15:59.827877 systemd[1]: Created slice kubepods-burstable.slice - libcontainer container kubepods-burstable.slice. Nov 1 00:15:59.833360 systemd[1]: Created slice kubepods-besteffort.slice - libcontainer container kubepods-besteffort.slice. Nov 1 00:15:59.837376 kubelet[1755]: I1101 00:15:59.837218 1755 kubelet_network_linux.go:50] "Initialized iptables rules." protocol="IPv4" Nov 1 00:15:59.838910 kubelet[1755]: I1101 00:15:59.838874 1755 kubelet_network_linux.go:50] "Initialized iptables rules." protocol="IPv6" Nov 1 00:15:59.839117 kubelet[1755]: I1101 00:15:59.838916 1755 status_manager.go:227] "Starting to sync pod status with apiserver" Nov 1 00:15:59.839117 kubelet[1755]: I1101 00:15:59.838948 1755 watchdog_linux.go:127] "Systemd watchdog is not enabled or the interval is invalid, so health checking will not be started." Nov 1 00:15:59.839117 kubelet[1755]: I1101 00:15:59.838961 1755 kubelet.go:2382] "Starting kubelet main sync loop" Nov 1 00:15:59.839117 kubelet[1755]: E1101 00:15:59.839027 1755 kubelet.go:2406] "Skipping pod synchronization" err="[container runtime status check may not have completed yet, PLEG is not healthy: pleg has yet to be successful]" Nov 1 00:15:59.841495 kubelet[1755]: I1101 00:15:59.841448 1755 manager.go:519] "Failed to read data from checkpoint" checkpoint="kubelet_internal_checkpoint" err="checkpoint is not found" Nov 1 00:15:59.843933 kubelet[1755]: I1101 00:15:59.843652 1755 eviction_manager.go:189] "Eviction manager: starting control loop" Nov 1 00:15:59.844934 kubelet[1755]: I1101 00:15:59.843720 1755 container_log_manager.go:189] "Initializing container log rotate workers" workers=1 monitorPeriod="10s" Nov 1 00:15:59.845053 kubelet[1755]: E1101 00:15:59.844931 1755 eviction_manager.go:267] "eviction manager: failed to check if we have separate container filesystem. Ignoring." err="no imagefs label for configured runtime" Nov 1 00:15:59.845053 kubelet[1755]: E1101 00:15:59.844982 1755 eviction_manager.go:292] "Eviction manager: failed to get summary stats" err="failed to get node info: node \"10.0.0.42\" not found" Nov 1 00:15:59.845257 kubelet[1755]: I1101 00:15:59.845227 1755 plugin_manager.go:118] "Starting Kubelet Plugin Manager" Nov 1 00:15:59.946318 kubelet[1755]: I1101 00:15:59.946269 1755 kubelet_node_status.go:75] "Attempting to register node" node="10.0.0.42" Nov 1 00:15:59.953033 kubelet[1755]: I1101 00:15:59.952978 1755 kubelet_node_status.go:78] "Successfully registered node" node="10.0.0.42" Nov 1 00:15:59.953033 kubelet[1755]: E1101 00:15:59.953022 1755 kubelet_node_status.go:548] "Error updating node status, will retry" err="error getting node \"10.0.0.42\": node \"10.0.0.42\" not found" Nov 1 00:15:59.970278 kubelet[1755]: I1101 00:15:59.970237 1755 kuberuntime_manager.go:1702] "Updating runtime config through cri with podcidr" CIDR="192.168.1.0/24" Nov 1 00:15:59.970753 containerd[1472]: time="2025-11-01T00:15:59.970653128Z" level=info msg="No cni config template is specified, wait for other system components to drop the config." Nov 1 00:15:59.971326 kubelet[1755]: I1101 00:15:59.971101 1755 kubelet_network.go:61] "Updating Pod CIDR" originalPodCIDR="" newPodCIDR="192.168.1.0/24" Nov 1 00:15:59.984157 sudo[1611]: pam_unix(sudo:session): session closed for user root Nov 1 00:15:59.986686 sshd[1608]: pam_unix(sshd:session): session closed for user core Nov 1 00:15:59.990751 systemd[1]: sshd@6-10.0.0.42:22-10.0.0.1:59232.service: Deactivated successfully. Nov 1 00:15:59.993335 systemd[1]: session-7.scope: Deactivated successfully. Nov 1 00:15:59.994245 systemd-logind[1446]: Session 7 logged out. Waiting for processes to exit. Nov 1 00:15:59.995356 systemd-logind[1446]: Removed session 7. Nov 1 00:16:00.299342 kubelet[1755]: I1101 00:16:00.299103 1755 transport.go:147] "Certificate rotation detected, shutting down client connections to start using new credentials" Nov 1 00:16:00.299865 kubelet[1755]: W1101 00:16:00.299452 1755 reflector.go:492] k8s.io/client-go/informers/factory.go:160: watch of *v1.RuntimeClass ended with: very short watch: k8s.io/client-go/informers/factory.go:160: Unexpected watch close - watch lasted less than a second and no items received Nov 1 00:16:00.299865 kubelet[1755]: W1101 00:16:00.299520 1755 reflector.go:492] k8s.io/client-go/informers/factory.go:160: watch of *v1.Service ended with: very short watch: k8s.io/client-go/informers/factory.go:160: Unexpected watch close - watch lasted less than a second and no items received Nov 1 00:16:00.299865 kubelet[1755]: W1101 00:16:00.299553 1755 reflector.go:492] k8s.io/client-go/informers/factory.go:160: watch of *v1.CSIDriver ended with: very short watch: k8s.io/client-go/informers/factory.go:160: Unexpected watch close - watch lasted less than a second and no items received Nov 1 00:16:00.359171 kubelet[1755]: E1101 00:16:00.359133 1755 file_linux.go:61] "Unable to read config path" err="path does not exist, ignoring" path="/etc/kubernetes/manifests" Nov 1 00:16:00.359171 kubelet[1755]: I1101 00:16:00.359165 1755 apiserver.go:52] "Watching apiserver" Nov 1 00:16:00.369884 systemd[1]: Created slice kubepods-burstable-pod819f2dd9_2287_4511_8c2a_b79ddf2bfdc8.slice - libcontainer container kubepods-burstable-pod819f2dd9_2287_4511_8c2a_b79ddf2bfdc8.slice. Nov 1 00:16:00.370880 kubelet[1755]: I1101 00:16:00.370844 1755 desired_state_of_world_populator.go:158] "Finished populating initial desired state of world" Nov 1 00:16:00.375539 kubelet[1755]: I1101 00:16:00.375500 1755 reconciler_common.go:251] "operationExecutor.VerifyControllerAttachedVolume started for volume \"xtables-lock\" (UniqueName: \"kubernetes.io/host-path/819f2dd9-2287-4511-8c2a-b79ddf2bfdc8-xtables-lock\") pod \"kube-flannel-ds-gqsbg\" (UID: \"819f2dd9-2287-4511-8c2a-b79ddf2bfdc8\") " pod="kube-flannel/kube-flannel-ds-gqsbg" Nov 1 00:16:00.375539 kubelet[1755]: I1101 00:16:00.375532 1755 reconciler_common.go:251] "operationExecutor.VerifyControllerAttachedVolume started for volume \"kube-proxy\" (UniqueName: \"kubernetes.io/configmap/356c3c9d-ab13-4724-a6b7-847420d8d578-kube-proxy\") pod \"kube-proxy-8bx7l\" (UID: \"356c3c9d-ab13-4724-a6b7-847420d8d578\") " pod="kube-system/kube-proxy-8bx7l" Nov 1 00:16:00.375644 kubelet[1755]: I1101 00:16:00.375555 1755 reconciler_common.go:251] "operationExecutor.VerifyControllerAttachedVolume started for volume \"run\" (UniqueName: \"kubernetes.io/host-path/819f2dd9-2287-4511-8c2a-b79ddf2bfdc8-run\") pod \"kube-flannel-ds-gqsbg\" (UID: \"819f2dd9-2287-4511-8c2a-b79ddf2bfdc8\") " pod="kube-flannel/kube-flannel-ds-gqsbg" Nov 1 00:16:00.375644 kubelet[1755]: I1101 00:16:00.375577 1755 reconciler_common.go:251] "operationExecutor.VerifyControllerAttachedVolume started for volume \"cni-plugin\" (UniqueName: \"kubernetes.io/host-path/819f2dd9-2287-4511-8c2a-b79ddf2bfdc8-cni-plugin\") pod \"kube-flannel-ds-gqsbg\" (UID: \"819f2dd9-2287-4511-8c2a-b79ddf2bfdc8\") " pod="kube-flannel/kube-flannel-ds-gqsbg" Nov 1 00:16:00.375644 kubelet[1755]: I1101 00:16:00.375607 1755 reconciler_common.go:251] "operationExecutor.VerifyControllerAttachedVolume started for volume \"cni\" (UniqueName: \"kubernetes.io/host-path/819f2dd9-2287-4511-8c2a-b79ddf2bfdc8-cni\") pod \"kube-flannel-ds-gqsbg\" (UID: \"819f2dd9-2287-4511-8c2a-b79ddf2bfdc8\") " pod="kube-flannel/kube-flannel-ds-gqsbg" Nov 1 00:16:00.375644 kubelet[1755]: I1101 00:16:00.375640 1755 reconciler_common.go:251] "operationExecutor.VerifyControllerAttachedVolume started for volume \"flannel-cfg\" (UniqueName: \"kubernetes.io/configmap/819f2dd9-2287-4511-8c2a-b79ddf2bfdc8-flannel-cfg\") pod \"kube-flannel-ds-gqsbg\" (UID: \"819f2dd9-2287-4511-8c2a-b79ddf2bfdc8\") " pod="kube-flannel/kube-flannel-ds-gqsbg" Nov 1 00:16:00.375784 kubelet[1755]: I1101 00:16:00.375667 1755 reconciler_common.go:251] "operationExecutor.VerifyControllerAttachedVolume started for volume \"xtables-lock\" (UniqueName: \"kubernetes.io/host-path/356c3c9d-ab13-4724-a6b7-847420d8d578-xtables-lock\") pod \"kube-proxy-8bx7l\" (UID: \"356c3c9d-ab13-4724-a6b7-847420d8d578\") " pod="kube-system/kube-proxy-8bx7l" Nov 1 00:16:00.375784 kubelet[1755]: I1101 00:16:00.375689 1755 reconciler_common.go:251] "operationExecutor.VerifyControllerAttachedVolume started for volume \"lib-modules\" (UniqueName: \"kubernetes.io/host-path/356c3c9d-ab13-4724-a6b7-847420d8d578-lib-modules\") pod \"kube-proxy-8bx7l\" (UID: \"356c3c9d-ab13-4724-a6b7-847420d8d578\") " pod="kube-system/kube-proxy-8bx7l" Nov 1 00:16:00.375784 kubelet[1755]: I1101 00:16:00.375714 1755 reconciler_common.go:251] "operationExecutor.VerifyControllerAttachedVolume started for volume \"kube-api-access-vlgn9\" (UniqueName: \"kubernetes.io/projected/356c3c9d-ab13-4724-a6b7-847420d8d578-kube-api-access-vlgn9\") pod \"kube-proxy-8bx7l\" (UID: \"356c3c9d-ab13-4724-a6b7-847420d8d578\") " pod="kube-system/kube-proxy-8bx7l" Nov 1 00:16:00.375784 kubelet[1755]: I1101 00:16:00.375740 1755 reconciler_common.go:251] "operationExecutor.VerifyControllerAttachedVolume started for volume \"kube-api-access-rfv5s\" (UniqueName: \"kubernetes.io/projected/819f2dd9-2287-4511-8c2a-b79ddf2bfdc8-kube-api-access-rfv5s\") pod \"kube-flannel-ds-gqsbg\" (UID: \"819f2dd9-2287-4511-8c2a-b79ddf2bfdc8\") " pod="kube-flannel/kube-flannel-ds-gqsbg" Nov 1 00:16:00.379703 systemd[1]: Created slice kubepods-besteffort-pod356c3c9d_ab13_4724_a6b7_847420d8d578.slice - libcontainer container kubepods-besteffort-pod356c3c9d_ab13_4724_a6b7_847420d8d578.slice. Nov 1 00:16:00.679085 kubelet[1755]: E1101 00:16:00.678894 1755 dns.go:153] "Nameserver limits exceeded" err="Nameserver limits were exceeded, some nameservers have been omitted, the applied nameserver line is: 1.1.1.1 1.0.0.1 8.8.8.8" Nov 1 00:16:00.680187 containerd[1472]: time="2025-11-01T00:16:00.680089551Z" level=info msg="RunPodSandbox for &PodSandboxMetadata{Name:kube-flannel-ds-gqsbg,Uid:819f2dd9-2287-4511-8c2a-b79ddf2bfdc8,Namespace:kube-flannel,Attempt:0,}" Nov 1 00:16:00.689615 kubelet[1755]: E1101 00:16:00.689568 1755 dns.go:153] "Nameserver limits exceeded" err="Nameserver limits were exceeded, some nameservers have been omitted, the applied nameserver line is: 1.1.1.1 1.0.0.1 8.8.8.8" Nov 1 00:16:00.690135 containerd[1472]: time="2025-11-01T00:16:00.690074924Z" level=info msg="RunPodSandbox for &PodSandboxMetadata{Name:kube-proxy-8bx7l,Uid:356c3c9d-ab13-4724-a6b7-847420d8d578,Namespace:kube-system,Attempt:0,}" Nov 1 00:16:01.360329 kubelet[1755]: E1101 00:16:01.360260 1755 file_linux.go:61] "Unable to read config path" err="path does not exist, ignoring" path="/etc/kubernetes/manifests" Nov 1 00:16:02.237626 systemd[1]: var-lib-containerd-tmpmounts-containerd\x2dmount3609903687.mount: Deactivated successfully. Nov 1 00:16:02.248218 containerd[1472]: time="2025-11-01T00:16:02.248177115Z" level=info msg="ImageCreate event name:\"registry.k8s.io/pause:3.8\" labels:{key:\"io.cri-containerd.image\" value:\"managed\"} labels:{key:\"io.cri-containerd.pinned\" value:\"pinned\"}" Nov 1 00:16:02.249257 containerd[1472]: time="2025-11-01T00:16:02.249230009Z" level=info msg="ImageUpdate event name:\"registry.k8s.io/pause:3.8\" labels:{key:\"io.cri-containerd.image\" value:\"managed\"} labels:{key:\"io.cri-containerd.pinned\" value:\"pinned\"}" Nov 1 00:16:02.249917 containerd[1472]: time="2025-11-01T00:16:02.249868116Z" level=info msg="stop pulling image registry.k8s.io/pause:3.8: active requests=0, bytes read=312056" Nov 1 00:16:02.251011 containerd[1472]: time="2025-11-01T00:16:02.250960504Z" level=info msg="stop pulling image registry.k8s.io/pause:3.8: active requests=0, bytes read=0" Nov 1 00:16:02.251894 containerd[1472]: time="2025-11-01T00:16:02.251853448Z" level=info msg="ImageCreate event name:\"sha256:4873874c08efc72e9729683a83ffbb7502ee729e9a5ac097723806ea7fa13517\" labels:{key:\"io.cri-containerd.image\" value:\"managed\"} labels:{key:\"io.cri-containerd.pinned\" value:\"pinned\"}" Nov 1 00:16:02.255726 containerd[1472]: time="2025-11-01T00:16:02.255668481Z" level=info msg="Pulled image \"registry.k8s.io/pause:3.8\" with image id \"sha256:4873874c08efc72e9729683a83ffbb7502ee729e9a5ac097723806ea7fa13517\", repo tag \"registry.k8s.io/pause:3.8\", repo digest \"registry.k8s.io/pause@sha256:9001185023633d17a2f98ff69b6ff2615b8ea02a825adffa40422f51dfdcde9d\", size \"311286\" in 1.575380348s" Nov 1 00:16:02.257146 containerd[1472]: time="2025-11-01T00:16:02.257090157Z" level=info msg="ImageCreate event name:\"registry.k8s.io/pause@sha256:9001185023633d17a2f98ff69b6ff2615b8ea02a825adffa40422f51dfdcde9d\" labels:{key:\"io.cri-containerd.image\" value:\"managed\"} labels:{key:\"io.cri-containerd.pinned\" value:\"pinned\"}" Nov 1 00:16:02.258921 containerd[1472]: time="2025-11-01T00:16:02.258880925Z" level=info msg="Pulled image \"registry.k8s.io/pause:3.8\" with image id \"sha256:4873874c08efc72e9729683a83ffbb7502ee729e9a5ac097723806ea7fa13517\", repo tag \"registry.k8s.io/pause:3.8\", repo digest \"registry.k8s.io/pause@sha256:9001185023633d17a2f98ff69b6ff2615b8ea02a825adffa40422f51dfdcde9d\", size \"311286\" in 1.568645941s" Nov 1 00:16:02.361328 kubelet[1755]: E1101 00:16:02.361255 1755 file_linux.go:61] "Unable to read config path" err="path does not exist, ignoring" path="/etc/kubernetes/manifests" Nov 1 00:16:02.840430 containerd[1472]: time="2025-11-01T00:16:02.839359341Z" level=info msg="loading plugin \"io.containerd.event.v1.publisher\"..." runtime=io.containerd.runc.v2 type=io.containerd.event.v1 Nov 1 00:16:02.840430 containerd[1472]: time="2025-11-01T00:16:02.839435334Z" level=info msg="loading plugin \"io.containerd.internal.v1.shutdown\"..." runtime=io.containerd.runc.v2 type=io.containerd.internal.v1 Nov 1 00:16:02.840430 containerd[1472]: time="2025-11-01T00:16:02.839458237Z" level=info msg="loading plugin \"io.containerd.ttrpc.v1.task\"..." runtime=io.containerd.runc.v2 type=io.containerd.ttrpc.v1 Nov 1 00:16:02.840430 containerd[1472]: time="2025-11-01T00:16:02.839863407Z" level=info msg="loading plugin \"io.containerd.ttrpc.v1.pause\"..." runtime=io.containerd.runc.v2 type=io.containerd.ttrpc.v1 Nov 1 00:16:02.852453 containerd[1472]: time="2025-11-01T00:16:02.852328158Z" level=info msg="loading plugin \"io.containerd.event.v1.publisher\"..." runtime=io.containerd.runc.v2 type=io.containerd.event.v1 Nov 1 00:16:02.852453 containerd[1472]: time="2025-11-01T00:16:02.852405543Z" level=info msg="loading plugin \"io.containerd.internal.v1.shutdown\"..." runtime=io.containerd.runc.v2 type=io.containerd.internal.v1 Nov 1 00:16:02.852453 containerd[1472]: time="2025-11-01T00:16:02.852420611Z" level=info msg="loading plugin \"io.containerd.ttrpc.v1.task\"..." runtime=io.containerd.runc.v2 type=io.containerd.ttrpc.v1 Nov 1 00:16:02.852918 containerd[1472]: time="2025-11-01T00:16:02.852846590Z" level=info msg="loading plugin \"io.containerd.ttrpc.v1.pause\"..." runtime=io.containerd.runc.v2 type=io.containerd.ttrpc.v1 Nov 1 00:16:03.362170 kubelet[1755]: E1101 00:16:03.362108 1755 file_linux.go:61] "Unable to read config path" err="path does not exist, ignoring" path="/etc/kubernetes/manifests" Nov 1 00:16:03.467218 systemd[1]: Started cri-containerd-86482a7532056363234408c1e7dffb1c8b4ca430fda069b20a4d959876928915.scope - libcontainer container 86482a7532056363234408c1e7dffb1c8b4ca430fda069b20a4d959876928915. Nov 1 00:16:03.473039 systemd[1]: Started cri-containerd-0d40519d303a46db1456654523f7ef42e8e508e77ae5aa1f73766a708504238d.scope - libcontainer container 0d40519d303a46db1456654523f7ef42e8e508e77ae5aa1f73766a708504238d. Nov 1 00:16:03.532447 containerd[1472]: time="2025-11-01T00:16:03.532306427Z" level=info msg="RunPodSandbox for &PodSandboxMetadata{Name:kube-proxy-8bx7l,Uid:356c3c9d-ab13-4724-a6b7-847420d8d578,Namespace:kube-system,Attempt:0,} returns sandbox id \"86482a7532056363234408c1e7dffb1c8b4ca430fda069b20a4d959876928915\"" Nov 1 00:16:03.535282 kubelet[1755]: E1101 00:16:03.534150 1755 dns.go:153] "Nameserver limits exceeded" err="Nameserver limits were exceeded, some nameservers have been omitted, the applied nameserver line is: 1.1.1.1 1.0.0.1 8.8.8.8" Nov 1 00:16:03.536599 containerd[1472]: time="2025-11-01T00:16:03.536558069Z" level=info msg="PullImage \"registry.k8s.io/kube-proxy:v1.32.9\"" Nov 1 00:16:03.550682 containerd[1472]: time="2025-11-01T00:16:03.550641275Z" level=info msg="RunPodSandbox for &PodSandboxMetadata{Name:kube-flannel-ds-gqsbg,Uid:819f2dd9-2287-4511-8c2a-b79ddf2bfdc8,Namespace:kube-flannel,Attempt:0,} returns sandbox id \"0d40519d303a46db1456654523f7ef42e8e508e77ae5aa1f73766a708504238d\"" Nov 1 00:16:03.551934 kubelet[1755]: E1101 00:16:03.551792 1755 dns.go:153] "Nameserver limits exceeded" err="Nameserver limits were exceeded, some nameservers have been omitted, the applied nameserver line is: 1.1.1.1 1.0.0.1 8.8.8.8" Nov 1 00:16:04.452023 kubelet[1755]: E1101 00:16:04.451939 1755 file_linux.go:61] "Unable to read config path" err="path does not exist, ignoring" path="/etc/kubernetes/manifests" Nov 1 00:16:05.384682 systemd[1]: var-lib-containerd-tmpmounts-containerd\x2dmount480671659.mount: Deactivated successfully. Nov 1 00:16:05.453089 kubelet[1755]: E1101 00:16:05.453013 1755 file_linux.go:61] "Unable to read config path" err="path does not exist, ignoring" path="/etc/kubernetes/manifests" Nov 1 00:16:06.464328 kubelet[1755]: E1101 00:16:06.464202 1755 file_linux.go:61] "Unable to read config path" err="path does not exist, ignoring" path="/etc/kubernetes/manifests" Nov 1 00:16:06.517984 containerd[1472]: time="2025-11-01T00:16:06.517925873Z" level=info msg="ImageCreate event name:\"registry.k8s.io/kube-proxy:v1.32.9\" labels:{key:\"io.cri-containerd.image\" value:\"managed\"}" Nov 1 00:16:06.518731 containerd[1472]: time="2025-11-01T00:16:06.518691829Z" level=info msg="stop pulling image registry.k8s.io/kube-proxy:v1.32.9: active requests=0, bytes read=30924206" Nov 1 00:16:06.519866 containerd[1472]: time="2025-11-01T00:16:06.519839230Z" level=info msg="ImageCreate event name:\"sha256:fa3fdca615a501743d8deb39729a96e731312aac8d96accec061d5265360332f\" labels:{key:\"io.cri-containerd.image\" value:\"managed\"}" Nov 1 00:16:06.522774 containerd[1472]: time="2025-11-01T00:16:06.522708440Z" level=info msg="ImageCreate event name:\"registry.k8s.io/kube-proxy@sha256:886af02535dc34886e4618b902f8c140d89af57233a245621d29642224516064\" labels:{key:\"io.cri-containerd.image\" value:\"managed\"}" Nov 1 00:16:06.523208 containerd[1472]: time="2025-11-01T00:16:06.523172891Z" level=info msg="Pulled image \"registry.k8s.io/kube-proxy:v1.32.9\" with image id \"sha256:fa3fdca615a501743d8deb39729a96e731312aac8d96accec061d5265360332f\", repo tag \"registry.k8s.io/kube-proxy:v1.32.9\", repo digest \"registry.k8s.io/kube-proxy@sha256:886af02535dc34886e4618b902f8c140d89af57233a245621d29642224516064\", size \"30923225\" in 2.986500948s" Nov 1 00:16:06.523208 containerd[1472]: time="2025-11-01T00:16:06.523202476Z" level=info msg="PullImage \"registry.k8s.io/kube-proxy:v1.32.9\" returns image reference \"sha256:fa3fdca615a501743d8deb39729a96e731312aac8d96accec061d5265360332f\"" Nov 1 00:16:06.524849 containerd[1472]: time="2025-11-01T00:16:06.524787639Z" level=info msg="PullImage \"docker.io/flannel/flannel-cni-plugin:v1.1.2\"" Nov 1 00:16:06.526319 containerd[1472]: time="2025-11-01T00:16:06.526270840Z" level=info msg="CreateContainer within sandbox \"86482a7532056363234408c1e7dffb1c8b4ca430fda069b20a4d959876928915\" for container &ContainerMetadata{Name:kube-proxy,Attempt:0,}" Nov 1 00:16:06.547976 containerd[1472]: time="2025-11-01T00:16:06.547895616Z" level=info msg="CreateContainer within sandbox \"86482a7532056363234408c1e7dffb1c8b4ca430fda069b20a4d959876928915\" for &ContainerMetadata{Name:kube-proxy,Attempt:0,} returns container id \"b044b0f0407295133c0d939a35373612e5a7d8d43e7d7d4d34c226fd91bb0ec4\"" Nov 1 00:16:06.548932 containerd[1472]: time="2025-11-01T00:16:06.548863861Z" level=info msg="StartContainer for \"b044b0f0407295133c0d939a35373612e5a7d8d43e7d7d4d34c226fd91bb0ec4\"" Nov 1 00:16:06.600040 systemd[1]: Started cri-containerd-b044b0f0407295133c0d939a35373612e5a7d8d43e7d7d4d34c226fd91bb0ec4.scope - libcontainer container b044b0f0407295133c0d939a35373612e5a7d8d43e7d7d4d34c226fd91bb0ec4. Nov 1 00:16:06.647893 containerd[1472]: time="2025-11-01T00:16:06.647762737Z" level=info msg="StartContainer for \"b044b0f0407295133c0d939a35373612e5a7d8d43e7d7d4d34c226fd91bb0ec4\" returns successfully" Nov 1 00:16:06.909409 kubelet[1755]: E1101 00:16:06.909260 1755 dns.go:153] "Nameserver limits exceeded" err="Nameserver limits were exceeded, some nameservers have been omitted, the applied nameserver line is: 1.1.1.1 1.0.0.1 8.8.8.8" Nov 1 00:16:07.465449 kubelet[1755]: E1101 00:16:07.465404 1755 file_linux.go:61] "Unable to read config path" err="path does not exist, ignoring" path="/etc/kubernetes/manifests" Nov 1 00:16:07.913228 kubelet[1755]: E1101 00:16:07.912480 1755 dns.go:153] "Nameserver limits exceeded" err="Nameserver limits were exceeded, some nameservers have been omitted, the applied nameserver line is: 1.1.1.1 1.0.0.1 8.8.8.8" Nov 1 00:16:08.466053 kubelet[1755]: E1101 00:16:08.465997 1755 file_linux.go:61] "Unable to read config path" err="path does not exist, ignoring" path="/etc/kubernetes/manifests" Nov 1 00:16:09.371058 systemd[1]: var-lib-containerd-tmpmounts-containerd\x2dmount2901942795.mount: Deactivated successfully. Nov 1 00:16:09.448825 containerd[1472]: time="2025-11-01T00:16:09.448698701Z" level=info msg="ImageCreate event name:\"docker.io/flannel/flannel-cni-plugin:v1.1.2\" labels:{key:\"io.cri-containerd.image\" value:\"managed\"}" Nov 1 00:16:09.449894 containerd[1472]: time="2025-11-01T00:16:09.449838478Z" level=info msg="stop pulling image docker.io/flannel/flannel-cni-plugin:v1.1.2: active requests=0, bytes read=3852937" Nov 1 00:16:09.451521 containerd[1472]: time="2025-11-01T00:16:09.451463806Z" level=info msg="ImageCreate event name:\"sha256:7a2dcab94698c786e7e41360faf8cd0ea2b29952469be75becc34c61902240e0\" labels:{key:\"io.cri-containerd.image\" value:\"managed\"}" Nov 1 00:16:09.453978 containerd[1472]: time="2025-11-01T00:16:09.453904572Z" level=info msg="ImageCreate event name:\"docker.io/flannel/flannel-cni-plugin@sha256:bf4b62b131666d040f35a327d906ee5a3418280b68a88d9b9c7e828057210443\" labels:{key:\"io.cri-containerd.image\" value:\"managed\"}" Nov 1 00:16:09.454748 containerd[1472]: time="2025-11-01T00:16:09.454696467Z" level=info msg="Pulled image \"docker.io/flannel/flannel-cni-plugin:v1.1.2\" with image id \"sha256:7a2dcab94698c786e7e41360faf8cd0ea2b29952469be75becc34c61902240e0\", repo tag \"docker.io/flannel/flannel-cni-plugin:v1.1.2\", repo digest \"docker.io/flannel/flannel-cni-plugin@sha256:bf4b62b131666d040f35a327d906ee5a3418280b68a88d9b9c7e828057210443\", size \"3842055\" in 2.929837054s" Nov 1 00:16:09.454748 containerd[1472]: time="2025-11-01T00:16:09.454742694Z" level=info msg="PullImage \"docker.io/flannel/flannel-cni-plugin:v1.1.2\" returns image reference \"sha256:7a2dcab94698c786e7e41360faf8cd0ea2b29952469be75becc34c61902240e0\"" Nov 1 00:16:09.457956 containerd[1472]: time="2025-11-01T00:16:09.457906265Z" level=info msg="CreateContainer within sandbox \"0d40519d303a46db1456654523f7ef42e8e508e77ae5aa1f73766a708504238d\" for container &ContainerMetadata{Name:install-cni-plugin,Attempt:0,}" Nov 1 00:16:09.466430 kubelet[1755]: E1101 00:16:09.466297 1755 file_linux.go:61] "Unable to read config path" err="path does not exist, ignoring" path="/etc/kubernetes/manifests" Nov 1 00:16:09.514722 containerd[1472]: time="2025-11-01T00:16:09.514637496Z" level=info msg="CreateContainer within sandbox \"0d40519d303a46db1456654523f7ef42e8e508e77ae5aa1f73766a708504238d\" for &ContainerMetadata{Name:install-cni-plugin,Attempt:0,} returns container id \"63c7f48694697c9c73cf7141d5c896a2cb2a917e7021ed4a85d9c11b5bf84403\"" Nov 1 00:16:09.515711 containerd[1472]: time="2025-11-01T00:16:09.515649614Z" level=info msg="StartContainer for \"63c7f48694697c9c73cf7141d5c896a2cb2a917e7021ed4a85d9c11b5bf84403\"" Nov 1 00:16:09.635253 systemd[1]: Started cri-containerd-63c7f48694697c9c73cf7141d5c896a2cb2a917e7021ed4a85d9c11b5bf84403.scope - libcontainer container 63c7f48694697c9c73cf7141d5c896a2cb2a917e7021ed4a85d9c11b5bf84403. Nov 1 00:16:09.727842 containerd[1472]: time="2025-11-01T00:16:09.726385844Z" level=info msg="StartContainer for \"63c7f48694697c9c73cf7141d5c896a2cb2a917e7021ed4a85d9c11b5bf84403\" returns successfully" Nov 1 00:16:09.732367 systemd[1]: cri-containerd-63c7f48694697c9c73cf7141d5c896a2cb2a917e7021ed4a85d9c11b5bf84403.scope: Deactivated successfully. Nov 1 00:16:09.858499 systemd[1]: run-containerd-io.containerd.runtime.v2.task-k8s.io-63c7f48694697c9c73cf7141d5c896a2cb2a917e7021ed4a85d9c11b5bf84403-rootfs.mount: Deactivated successfully. Nov 1 00:16:09.928105 kubelet[1755]: E1101 00:16:09.926519 1755 dns.go:153] "Nameserver limits exceeded" err="Nameserver limits were exceeded, some nameservers have been omitted, the applied nameserver line is: 1.1.1.1 1.0.0.1 8.8.8.8" Nov 1 00:16:09.987176 kubelet[1755]: I1101 00:16:09.985115 1755 pod_startup_latency_tracker.go:104] "Observed pod startup duration" pod="kube-system/kube-proxy-8bx7l" podStartSLOduration=7.996174188 podStartE2EDuration="10.985080657s" podCreationTimestamp="2025-11-01 00:15:59 +0000 UTC" firstStartedPulling="2025-11-01 00:16:03.535677468 +0000 UTC m=+4.573912806" lastFinishedPulling="2025-11-01 00:16:06.524583656 +0000 UTC m=+7.562819275" observedRunningTime="2025-11-01 00:16:06.922579709 +0000 UTC m=+7.960815057" watchObservedRunningTime="2025-11-01 00:16:09.985080657 +0000 UTC m=+11.023315995" Nov 1 00:16:10.467019 kubelet[1755]: E1101 00:16:10.466931 1755 file_linux.go:61] "Unable to read config path" err="path does not exist, ignoring" path="/etc/kubernetes/manifests" Nov 1 00:16:10.528618 containerd[1472]: time="2025-11-01T00:16:10.528512872Z" level=info msg="shim disconnected" id=63c7f48694697c9c73cf7141d5c896a2cb2a917e7021ed4a85d9c11b5bf84403 namespace=k8s.io Nov 1 00:16:10.529199 containerd[1472]: time="2025-11-01T00:16:10.529126984Z" level=warning msg="cleaning up after shim disconnected" id=63c7f48694697c9c73cf7141d5c896a2cb2a917e7021ed4a85d9c11b5bf84403 namespace=k8s.io Nov 1 00:16:10.529199 containerd[1472]: time="2025-11-01T00:16:10.529190543Z" level=info msg="cleaning up dead shim" namespace=k8s.io Nov 1 00:16:10.930057 kubelet[1755]: E1101 00:16:10.929873 1755 dns.go:153] "Nameserver limits exceeded" err="Nameserver limits were exceeded, some nameservers have been omitted, the applied nameserver line is: 1.1.1.1 1.0.0.1 8.8.8.8" Nov 1 00:16:10.930782 containerd[1472]: time="2025-11-01T00:16:10.930735790Z" level=info msg="PullImage \"docker.io/flannel/flannel:v0.22.0\"" Nov 1 00:16:11.467156 kubelet[1755]: E1101 00:16:11.467072 1755 file_linux.go:61] "Unable to read config path" err="path does not exist, ignoring" path="/etc/kubernetes/manifests" Nov 1 00:16:12.467248 kubelet[1755]: E1101 00:16:12.467205 1755 file_linux.go:61] "Unable to read config path" err="path does not exist, ignoring" path="/etc/kubernetes/manifests" Nov 1 00:16:13.467796 kubelet[1755]: E1101 00:16:13.467727 1755 file_linux.go:61] "Unable to read config path" err="path does not exist, ignoring" path="/etc/kubernetes/manifests" Nov 1 00:16:14.401733 systemd[1]: var-lib-containerd-tmpmounts-containerd\x2dmount3198405843.mount: Deactivated successfully. Nov 1 00:16:14.468881 kubelet[1755]: E1101 00:16:14.468715 1755 file_linux.go:61] "Unable to read config path" err="path does not exist, ignoring" path="/etc/kubernetes/manifests" Nov 1 00:16:15.469723 kubelet[1755]: E1101 00:16:15.469561 1755 file_linux.go:61] "Unable to read config path" err="path does not exist, ignoring" path="/etc/kubernetes/manifests" Nov 1 00:16:15.885600 containerd[1472]: time="2025-11-01T00:16:15.885329729Z" level=info msg="ImageCreate event name:\"docker.io/flannel/flannel:v0.22.0\" labels:{key:\"io.cri-containerd.image\" value:\"managed\"}" Nov 1 00:16:15.886447 containerd[1472]: time="2025-11-01T00:16:15.886381748Z" level=info msg="stop pulling image docker.io/flannel/flannel:v0.22.0: active requests=0, bytes read=26866358" Nov 1 00:16:15.887892 containerd[1472]: time="2025-11-01T00:16:15.887861012Z" level=info msg="ImageCreate event name:\"sha256:38c11b8f4aa1904512c0b3e93d34604de20ba24b38d4365d27fe05b7a4ce6f68\" labels:{key:\"io.cri-containerd.image\" value:\"managed\"}" Nov 1 00:16:15.893558 containerd[1472]: time="2025-11-01T00:16:15.893527588Z" level=info msg="ImageCreate event name:\"docker.io/flannel/flannel@sha256:5f83f1243057458e27249157394e3859cf31cc075354af150d497f2ebc8b54db\" labels:{key:\"io.cri-containerd.image\" value:\"managed\"}" Nov 1 00:16:15.894940 containerd[1472]: time="2025-11-01T00:16:15.894867172Z" level=info msg="Pulled image \"docker.io/flannel/flannel:v0.22.0\" with image id \"sha256:38c11b8f4aa1904512c0b3e93d34604de20ba24b38d4365d27fe05b7a4ce6f68\", repo tag \"docker.io/flannel/flannel:v0.22.0\", repo digest \"docker.io/flannel/flannel@sha256:5f83f1243057458e27249157394e3859cf31cc075354af150d497f2ebc8b54db\", size \"26855532\" in 4.964082652s" Nov 1 00:16:15.894940 containerd[1472]: time="2025-11-01T00:16:15.894931677Z" level=info msg="PullImage \"docker.io/flannel/flannel:v0.22.0\" returns image reference \"sha256:38c11b8f4aa1904512c0b3e93d34604de20ba24b38d4365d27fe05b7a4ce6f68\"" Nov 1 00:16:15.898309 containerd[1472]: time="2025-11-01T00:16:15.898260266Z" level=info msg="CreateContainer within sandbox \"0d40519d303a46db1456654523f7ef42e8e508e77ae5aa1f73766a708504238d\" for container &ContainerMetadata{Name:install-cni,Attempt:0,}" Nov 1 00:16:15.928217 containerd[1472]: time="2025-11-01T00:16:15.928128280Z" level=info msg="CreateContainer within sandbox \"0d40519d303a46db1456654523f7ef42e8e508e77ae5aa1f73766a708504238d\" for &ContainerMetadata{Name:install-cni,Attempt:0,} returns container id \"c8835be36e1668e54b36b879d3b29a93722943c3ca89e44297a126adcfc39c84\"" Nov 1 00:16:15.928936 containerd[1472]: time="2025-11-01T00:16:15.928903766Z" level=info msg="StartContainer for \"c8835be36e1668e54b36b879d3b29a93722943c3ca89e44297a126adcfc39c84\"" Nov 1 00:16:15.975010 systemd[1]: Started cri-containerd-c8835be36e1668e54b36b879d3b29a93722943c3ca89e44297a126adcfc39c84.scope - libcontainer container c8835be36e1668e54b36b879d3b29a93722943c3ca89e44297a126adcfc39c84. Nov 1 00:16:16.017975 systemd[1]: cri-containerd-c8835be36e1668e54b36b879d3b29a93722943c3ca89e44297a126adcfc39c84.scope: Deactivated successfully. Nov 1 00:16:16.020659 containerd[1472]: time="2025-11-01T00:16:16.020604585Z" level=info msg="StartContainer for \"c8835be36e1668e54b36b879d3b29a93722943c3ca89e44297a126adcfc39c84\" returns successfully" Nov 1 00:16:16.045253 systemd[1]: run-containerd-io.containerd.runtime.v2.task-k8s.io-c8835be36e1668e54b36b879d3b29a93722943c3ca89e44297a126adcfc39c84-rootfs.mount: Deactivated successfully. Nov 1 00:16:16.112547 kubelet[1755]: I1101 00:16:16.112506 1755 kubelet_node_status.go:501] "Fast updating node status as it just became ready" Nov 1 00:16:16.441181 containerd[1472]: time="2025-11-01T00:16:16.441089752Z" level=info msg="shim disconnected" id=c8835be36e1668e54b36b879d3b29a93722943c3ca89e44297a126adcfc39c84 namespace=k8s.io Nov 1 00:16:16.441181 containerd[1472]: time="2025-11-01T00:16:16.441169735Z" level=warning msg="cleaning up after shim disconnected" id=c8835be36e1668e54b36b879d3b29a93722943c3ca89e44297a126adcfc39c84 namespace=k8s.io Nov 1 00:16:16.441181 containerd[1472]: time="2025-11-01T00:16:16.441181055Z" level=info msg="cleaning up dead shim" namespace=k8s.io Nov 1 00:16:16.470573 kubelet[1755]: E1101 00:16:16.470517 1755 file_linux.go:61] "Unable to read config path" err="path does not exist, ignoring" path="/etc/kubernetes/manifests" Nov 1 00:16:16.965781 kubelet[1755]: E1101 00:16:16.965713 1755 dns.go:153] "Nameserver limits exceeded" err="Nameserver limits were exceeded, some nameservers have been omitted, the applied nameserver line is: 1.1.1.1 1.0.0.1 8.8.8.8" Nov 1 00:16:16.969791 containerd[1472]: time="2025-11-01T00:16:16.969568747Z" level=info msg="CreateContainer within sandbox \"0d40519d303a46db1456654523f7ef42e8e508e77ae5aa1f73766a708504238d\" for container &ContainerMetadata{Name:kube-flannel,Attempt:0,}" Nov 1 00:16:17.006988 containerd[1472]: time="2025-11-01T00:16:17.006914722Z" level=info msg="CreateContainer within sandbox \"0d40519d303a46db1456654523f7ef42e8e508e77ae5aa1f73766a708504238d\" for &ContainerMetadata{Name:kube-flannel,Attempt:0,} returns container id \"b1dd54270befd6b7b6a3a0216d241eeb41fc641d8e6de896ae002188adad8792\"" Nov 1 00:16:17.007922 containerd[1472]: time="2025-11-01T00:16:17.007842450Z" level=info msg="StartContainer for \"b1dd54270befd6b7b6a3a0216d241eeb41fc641d8e6de896ae002188adad8792\"" Nov 1 00:16:17.060331 systemd[1]: Started cri-containerd-b1dd54270befd6b7b6a3a0216d241eeb41fc641d8e6de896ae002188adad8792.scope - libcontainer container b1dd54270befd6b7b6a3a0216d241eeb41fc641d8e6de896ae002188adad8792. Nov 1 00:16:17.105917 containerd[1472]: time="2025-11-01T00:16:17.105833317Z" level=info msg="StartContainer for \"b1dd54270befd6b7b6a3a0216d241eeb41fc641d8e6de896ae002188adad8792\" returns successfully" Nov 1 00:16:17.471236 kubelet[1755]: E1101 00:16:17.471157 1755 file_linux.go:61] "Unable to read config path" err="path does not exist, ignoring" path="/etc/kubernetes/manifests" Nov 1 00:16:17.970163 kubelet[1755]: E1101 00:16:17.970103 1755 dns.go:153] "Nameserver limits exceeded" err="Nameserver limits were exceeded, some nameservers have been omitted, the applied nameserver line is: 1.1.1.1 1.0.0.1 8.8.8.8" Nov 1 00:16:18.183643 systemd-networkd[1401]: flannel.1: Link UP Nov 1 00:16:18.183653 systemd-networkd[1401]: flannel.1: Gained carrier Nov 1 00:16:18.472244 kubelet[1755]: E1101 00:16:18.472079 1755 file_linux.go:61] "Unable to read config path" err="path does not exist, ignoring" path="/etc/kubernetes/manifests" Nov 1 00:16:18.971505 kubelet[1755]: E1101 00:16:18.971473 1755 dns.go:153] "Nameserver limits exceeded" err="Nameserver limits were exceeded, some nameservers have been omitted, the applied nameserver line is: 1.1.1.1 1.0.0.1 8.8.8.8" Nov 1 00:16:19.358672 kubelet[1755]: E1101 00:16:19.358472 1755 file.go:104] "Unable to read config path" err="path does not exist, ignoring" path="/etc/kubernetes/manifests" Nov 1 00:16:19.472389 kubelet[1755]: E1101 00:16:19.472322 1755 file_linux.go:61] "Unable to read config path" err="path does not exist, ignoring" path="/etc/kubernetes/manifests" Nov 1 00:16:20.161089 systemd-networkd[1401]: flannel.1: Gained IPv6LL Nov 1 00:16:20.472557 kubelet[1755]: E1101 00:16:20.472474 1755 file_linux.go:61] "Unable to read config path" err="path does not exist, ignoring" path="/etc/kubernetes/manifests" Nov 1 00:16:21.473319 kubelet[1755]: E1101 00:16:21.473223 1755 file_linux.go:61] "Unable to read config path" err="path does not exist, ignoring" path="/etc/kubernetes/manifests" Nov 1 00:16:21.816557 kubelet[1755]: I1101 00:16:21.816329 1755 pod_startup_latency_tracker.go:104] "Observed pod startup duration" pod="kube-flannel/kube-flannel-ds-gqsbg" podStartSLOduration=10.472409752 podStartE2EDuration="22.816303977s" podCreationTimestamp="2025-11-01 00:15:59 +0000 UTC" firstStartedPulling="2025-11-01 00:16:03.552559672 +0000 UTC m=+4.590795010" lastFinishedPulling="2025-11-01 00:16:15.896453897 +0000 UTC m=+16.934689235" observedRunningTime="2025-11-01 00:16:17.983110666 +0000 UTC m=+19.021346024" watchObservedRunningTime="2025-11-01 00:16:21.816303977 +0000 UTC m=+22.854539315" Nov 1 00:16:21.823614 systemd[1]: Created slice kubepods-besteffort-pod1cdba2b6_999f_4c95_b469_507f76e3a5ec.slice - libcontainer container kubepods-besteffort-pod1cdba2b6_999f_4c95_b469_507f76e3a5ec.slice. Nov 1 00:16:21.835956 kubelet[1755]: I1101 00:16:21.835891 1755 reconciler_common.go:251] "operationExecutor.VerifyControllerAttachedVolume started for volume \"kube-api-access-l76lq\" (UniqueName: \"kubernetes.io/projected/1cdba2b6-999f-4c95-b469-507f76e3a5ec-kube-api-access-l76lq\") pod \"nginx-deployment-7fcdb87857-q2rm9\" (UID: \"1cdba2b6-999f-4c95-b469-507f76e3a5ec\") " pod="default/nginx-deployment-7fcdb87857-q2rm9" Nov 1 00:16:22.128122 containerd[1472]: time="2025-11-01T00:16:22.127786559Z" level=info msg="RunPodSandbox for &PodSandboxMetadata{Name:nginx-deployment-7fcdb87857-q2rm9,Uid:1cdba2b6-999f-4c95-b469-507f76e3a5ec,Namespace:default,Attempt:0,}" Nov 1 00:16:22.473988 kubelet[1755]: E1101 00:16:22.473924 1755 file_linux.go:61] "Unable to read config path" err="path does not exist, ignoring" path="/etc/kubernetes/manifests" Nov 1 00:16:22.506181 systemd-networkd[1401]: cni0: Link UP Nov 1 00:16:22.506192 systemd-networkd[1401]: cni0: Gained carrier Nov 1 00:16:22.514142 systemd-networkd[1401]: vethf10e48af: Link UP Nov 1 00:16:22.514604 systemd-networkd[1401]: cni0: Lost carrier Nov 1 00:16:22.517989 kernel: cni0: port 1(vethf10e48af) entered blocking state Nov 1 00:16:22.518105 kernel: cni0: port 1(vethf10e48af) entered disabled state Nov 1 00:16:22.518129 kernel: vethf10e48af: entered allmulticast mode Nov 1 00:16:22.520826 kernel: vethf10e48af: entered promiscuous mode Nov 1 00:16:22.533483 kernel: cni0: port 1(vethf10e48af) entered blocking state Nov 1 00:16:22.533609 kernel: cni0: port 1(vethf10e48af) entered forwarding state Nov 1 00:16:22.534887 systemd-networkd[1401]: vethf10e48af: Gained carrier Nov 1 00:16:22.537312 systemd-networkd[1401]: cni0: Gained carrier Nov 1 00:16:22.540982 containerd[1472]: map[string]interface {}{"cniVersion":"0.3.1", "hairpinMode":true, "ipMasq":false, "ipam":map[string]interface {}{"ranges":[][]map[string]interface {}{[]map[string]interface {}{map[string]interface {}{"subnet":"192.168.1.0/24"}}}, "routes":[]types.Route{types.Route{Dst:net.IPNet{IP:net.IP{0xc0, 0xa8, 0x0, 0x0}, Mask:net.IPMask{0xff, 0xff, 0x80, 0x0}}, GW:net.IP(nil)}}, "type":"host-local"}, "isDefaultGateway":true, "isGateway":true, "mtu":(*uint)(0xc00011c8e8), "name":"cbr0", "type":"bridge"} Nov 1 00:16:22.540982 containerd[1472]: delegateAdd: netconf sent to delegate plugin: Nov 1 00:16:22.571373 containerd[1472]: {"cniVersion":"0.3.1","hairpinMode":true,"ipMasq":false,"ipam":{"ranges":[[{"subnet":"192.168.1.0/24"}]],"routes":[{"dst":"192.168.0.0/17"}],"type":"host-local"},"isDefaultGateway":true,"isGateway":true,"mtu":1450,"name":"cbr0","type":"bridge"}time="2025-11-01T00:16:22.570447609Z" level=info msg="loading plugin \"io.containerd.event.v1.publisher\"..." runtime=io.containerd.runc.v2 type=io.containerd.event.v1 Nov 1 00:16:22.571373 containerd[1472]: time="2025-11-01T00:16:22.571309067Z" level=info msg="loading plugin \"io.containerd.internal.v1.shutdown\"..." runtime=io.containerd.runc.v2 type=io.containerd.internal.v1 Nov 1 00:16:22.571373 containerd[1472]: time="2025-11-01T00:16:22.571324785Z" level=info msg="loading plugin \"io.containerd.ttrpc.v1.task\"..." runtime=io.containerd.runc.v2 type=io.containerd.ttrpc.v1 Nov 1 00:16:22.571644 containerd[1472]: time="2025-11-01T00:16:22.571418205Z" level=info msg="loading plugin \"io.containerd.ttrpc.v1.pause\"..." runtime=io.containerd.runc.v2 type=io.containerd.ttrpc.v1 Nov 1 00:16:22.596046 systemd[1]: Started cri-containerd-337915a81a1f6ef69d6458ae34abe46e134de3b57d8a5578d343ca44477e0ff3.scope - libcontainer container 337915a81a1f6ef69d6458ae34abe46e134de3b57d8a5578d343ca44477e0ff3. Nov 1 00:16:22.612248 systemd-resolved[1332]: Failed to determine the local hostname and LLMNR/mDNS names, ignoring: No such device or address Nov 1 00:16:22.643240 containerd[1472]: time="2025-11-01T00:16:22.643185480Z" level=info msg="RunPodSandbox for &PodSandboxMetadata{Name:nginx-deployment-7fcdb87857-q2rm9,Uid:1cdba2b6-999f-4c95-b469-507f76e3a5ec,Namespace:default,Attempt:0,} returns sandbox id \"337915a81a1f6ef69d6458ae34abe46e134de3b57d8a5578d343ca44477e0ff3\"" Nov 1 00:16:22.644963 containerd[1472]: time="2025-11-01T00:16:22.644932718Z" level=info msg="PullImage \"ghcr.io/flatcar/nginx:latest\"" Nov 1 00:16:23.474745 kubelet[1755]: E1101 00:16:23.474662 1755 file_linux.go:61] "Unable to read config path" err="path does not exist, ignoring" path="/etc/kubernetes/manifests" Nov 1 00:16:23.681053 systemd-networkd[1401]: cni0: Gained IPv6LL Nov 1 00:16:24.475283 kubelet[1755]: E1101 00:16:24.475212 1755 file_linux.go:61] "Unable to read config path" err="path does not exist, ignoring" path="/etc/kubernetes/manifests" Nov 1 00:16:24.513071 systemd-networkd[1401]: vethf10e48af: Gained IPv6LL Nov 1 00:16:25.475889 kubelet[1755]: E1101 00:16:25.475820 1755 file_linux.go:61] "Unable to read config path" err="path does not exist, ignoring" path="/etc/kubernetes/manifests" Nov 1 00:16:26.476317 kubelet[1755]: E1101 00:16:26.476249 1755 file_linux.go:61] "Unable to read config path" err="path does not exist, ignoring" path="/etc/kubernetes/manifests" Nov 1 00:16:26.873022 systemd[1]: var-lib-containerd-tmpmounts-containerd\x2dmount3803779600.mount: Deactivated successfully. Nov 1 00:16:27.477129 kubelet[1755]: E1101 00:16:27.477070 1755 file_linux.go:61] "Unable to read config path" err="path does not exist, ignoring" path="/etc/kubernetes/manifests" Nov 1 00:16:28.041240 update_engine[1448]: I20251101 00:16:28.041018 1448 update_attempter.cc:509] Updating boot flags... Nov 1 00:16:28.158890 kernel: BTRFS warning: duplicate device /dev/vda3 devid 1 generation 34 scanned by (udev-worker) (2453) Nov 1 00:16:28.188853 kernel: BTRFS warning: duplicate device /dev/vda3 devid 1 generation 34 scanned by (udev-worker) (2455) Nov 1 00:16:28.477931 kubelet[1755]: E1101 00:16:28.477886 1755 file_linux.go:61] "Unable to read config path" err="path does not exist, ignoring" path="/etc/kubernetes/manifests" Nov 1 00:16:29.091176 containerd[1472]: time="2025-11-01T00:16:29.091100783Z" level=info msg="ImageCreate event name:\"ghcr.io/flatcar/nginx:latest\" labels:{key:\"io.cri-containerd.image\" value:\"managed\"}" Nov 1 00:16:29.091768 containerd[1472]: time="2025-11-01T00:16:29.091702831Z" level=info msg="stop pulling image ghcr.io/flatcar/nginx:latest: active requests=0, bytes read=73311946" Nov 1 00:16:29.093164 containerd[1472]: time="2025-11-01T00:16:29.093105039Z" level=info msg="ImageCreate event name:\"sha256:8d14817f00613fe76ef7459f977ad93e7b71a3948346b7ac4d50e35f3dd518e9\" labels:{key:\"io.cri-containerd.image\" value:\"managed\"}" Nov 1 00:16:29.096696 containerd[1472]: time="2025-11-01T00:16:29.096629252Z" level=info msg="ImageCreate event name:\"ghcr.io/flatcar/nginx@sha256:0537df20ac7c5485a0f6b7bfb8e3fbbc8714fce070bab2a6344e5cadfba58d90\" labels:{key:\"io.cri-containerd.image\" value:\"managed\"}" Nov 1 00:16:29.097788 containerd[1472]: time="2025-11-01T00:16:29.097744333Z" level=info msg="Pulled image \"ghcr.io/flatcar/nginx:latest\" with image id \"sha256:8d14817f00613fe76ef7459f977ad93e7b71a3948346b7ac4d50e35f3dd518e9\", repo tag \"ghcr.io/flatcar/nginx:latest\", repo digest \"ghcr.io/flatcar/nginx@sha256:0537df20ac7c5485a0f6b7bfb8e3fbbc8714fce070bab2a6344e5cadfba58d90\", size \"73311824\" in 6.45277658s" Nov 1 00:16:29.097788 containerd[1472]: time="2025-11-01T00:16:29.097782112Z" level=info msg="PullImage \"ghcr.io/flatcar/nginx:latest\" returns image reference \"sha256:8d14817f00613fe76ef7459f977ad93e7b71a3948346b7ac4d50e35f3dd518e9\"" Nov 1 00:16:29.099864 containerd[1472]: time="2025-11-01T00:16:29.099835599Z" level=info msg="CreateContainer within sandbox \"337915a81a1f6ef69d6458ae34abe46e134de3b57d8a5578d343ca44477e0ff3\" for container &ContainerMetadata{Name:nginx,Attempt:0,}" Nov 1 00:16:29.115027 containerd[1472]: time="2025-11-01T00:16:29.114985565Z" level=info msg="CreateContainer within sandbox \"337915a81a1f6ef69d6458ae34abe46e134de3b57d8a5578d343ca44477e0ff3\" for &ContainerMetadata{Name:nginx,Attempt:0,} returns container id \"c6cf8f43166e6befa5ffa2743d2a48e0b445ecd58914f0ad3a15b3db9b486047\"" Nov 1 00:16:29.115528 containerd[1472]: time="2025-11-01T00:16:29.115490725Z" level=info msg="StartContainer for \"c6cf8f43166e6befa5ffa2743d2a48e0b445ecd58914f0ad3a15b3db9b486047\"" Nov 1 00:16:29.157997 systemd[1]: Started cri-containerd-c6cf8f43166e6befa5ffa2743d2a48e0b445ecd58914f0ad3a15b3db9b486047.scope - libcontainer container c6cf8f43166e6befa5ffa2743d2a48e0b445ecd58914f0ad3a15b3db9b486047. Nov 1 00:16:29.379524 containerd[1472]: time="2025-11-01T00:16:29.379366718Z" level=info msg="StartContainer for \"c6cf8f43166e6befa5ffa2743d2a48e0b445ecd58914f0ad3a15b3db9b486047\" returns successfully" Nov 1 00:16:29.478967 kubelet[1755]: E1101 00:16:29.478894 1755 file_linux.go:61] "Unable to read config path" err="path does not exist, ignoring" path="/etc/kubernetes/manifests" Nov 1 00:16:30.166313 kubelet[1755]: I1101 00:16:30.166238 1755 pod_startup_latency_tracker.go:104] "Observed pod startup duration" pod="default/nginx-deployment-7fcdb87857-q2rm9" podStartSLOduration=2.712082223 podStartE2EDuration="9.166216563s" podCreationTimestamp="2025-11-01 00:16:21 +0000 UTC" firstStartedPulling="2025-11-01 00:16:22.644524986 +0000 UTC m=+23.682760334" lastFinishedPulling="2025-11-01 00:16:29.098659336 +0000 UTC m=+30.136894674" observedRunningTime="2025-11-01 00:16:30.166069653 +0000 UTC m=+31.204304991" watchObservedRunningTime="2025-11-01 00:16:30.166216563 +0000 UTC m=+31.204451901" Nov 1 00:16:30.479134 kubelet[1755]: E1101 00:16:30.479061 1755 file_linux.go:61] "Unable to read config path" err="path does not exist, ignoring" path="/etc/kubernetes/manifests" Nov 1 00:16:31.479929 kubelet[1755]: E1101 00:16:31.479828 1755 file_linux.go:61] "Unable to read config path" err="path does not exist, ignoring" path="/etc/kubernetes/manifests" Nov 1 00:16:32.480763 kubelet[1755]: E1101 00:16:32.480650 1755 file_linux.go:61] "Unable to read config path" err="path does not exist, ignoring" path="/etc/kubernetes/manifests" Nov 1 00:16:33.136712 systemd[1]: Created slice kubepods-besteffort-pod58dd9312_22ca_438d_bfd6_c3f087753a3b.slice - libcontainer container kubepods-besteffort-pod58dd9312_22ca_438d_bfd6_c3f087753a3b.slice. Nov 1 00:16:33.286769 kubelet[1755]: I1101 00:16:33.286710 1755 reconciler_common.go:251] "operationExecutor.VerifyControllerAttachedVolume started for volume \"data\" (UniqueName: \"kubernetes.io/empty-dir/58dd9312-22ca-438d-bfd6-c3f087753a3b-data\") pod \"nfs-server-provisioner-0\" (UID: \"58dd9312-22ca-438d-bfd6-c3f087753a3b\") " pod="default/nfs-server-provisioner-0" Nov 1 00:16:33.286769 kubelet[1755]: I1101 00:16:33.286766 1755 reconciler_common.go:251] "operationExecutor.VerifyControllerAttachedVolume started for volume \"kube-api-access-r7spp\" (UniqueName: \"kubernetes.io/projected/58dd9312-22ca-438d-bfd6-c3f087753a3b-kube-api-access-r7spp\") pod \"nfs-server-provisioner-0\" (UID: \"58dd9312-22ca-438d-bfd6-c3f087753a3b\") " pod="default/nfs-server-provisioner-0" Nov 1 00:16:33.440657 containerd[1472]: time="2025-11-01T00:16:33.440484393Z" level=info msg="RunPodSandbox for &PodSandboxMetadata{Name:nfs-server-provisioner-0,Uid:58dd9312-22ca-438d-bfd6-c3f087753a3b,Namespace:default,Attempt:0,}" Nov 1 00:16:33.475328 systemd-networkd[1401]: vethb7e05971: Link UP Nov 1 00:16:33.478992 kernel: cni0: port 2(vethb7e05971) entered blocking state Nov 1 00:16:33.479051 kernel: cni0: port 2(vethb7e05971) entered disabled state Nov 1 00:16:33.479089 kernel: vethb7e05971: entered allmulticast mode Nov 1 00:16:33.481249 kubelet[1755]: E1101 00:16:33.481203 1755 file_linux.go:61] "Unable to read config path" err="path does not exist, ignoring" path="/etc/kubernetes/manifests" Nov 1 00:16:33.481967 kernel: vethb7e05971: entered promiscuous mode Nov 1 00:16:33.493793 kernel: cni0: port 2(vethb7e05971) entered blocking state Nov 1 00:16:33.493910 kernel: cni0: port 2(vethb7e05971) entered forwarding state Nov 1 00:16:33.494000 systemd-networkd[1401]: vethb7e05971: Gained carrier Nov 1 00:16:33.498078 containerd[1472]: map[string]interface {}{"cniVersion":"0.3.1", "hairpinMode":true, "ipMasq":false, "ipam":map[string]interface {}{"ranges":[][]map[string]interface {}{[]map[string]interface {}{map[string]interface {}{"subnet":"192.168.1.0/24"}}}, "routes":[]types.Route{types.Route{Dst:net.IPNet{IP:net.IP{0xc0, 0xa8, 0x0, 0x0}, Mask:net.IPMask{0xff, 0xff, 0x80, 0x0}}, GW:net.IP(nil)}}, "type":"host-local"}, "isDefaultGateway":true, "isGateway":true, "mtu":(*uint)(0xc00011c8e8), "name":"cbr0", "type":"bridge"} Nov 1 00:16:33.498078 containerd[1472]: delegateAdd: netconf sent to delegate plugin: Nov 1 00:16:33.524967 containerd[1472]: {"cniVersion":"0.3.1","hairpinMode":true,"ipMasq":false,"ipam":{"ranges":[[{"subnet":"192.168.1.0/24"}]],"routes":[{"dst":"192.168.0.0/17"}],"type":"host-local"},"isDefaultGateway":true,"isGateway":true,"mtu":1450,"name":"cbr0","type":"bridge"}time="2025-11-01T00:16:33.524836220Z" level=info msg="loading plugin \"io.containerd.event.v1.publisher\"..." runtime=io.containerd.runc.v2 type=io.containerd.event.v1 Nov 1 00:16:33.524967 containerd[1472]: time="2025-11-01T00:16:33.524909676Z" level=info msg="loading plugin \"io.containerd.internal.v1.shutdown\"..." runtime=io.containerd.runc.v2 type=io.containerd.internal.v1 Nov 1 00:16:33.524967 containerd[1472]: time="2025-11-01T00:16:33.524950922Z" level=info msg="loading plugin \"io.containerd.ttrpc.v1.task\"..." runtime=io.containerd.runc.v2 type=io.containerd.ttrpc.v1 Nov 1 00:16:33.525189 containerd[1472]: time="2025-11-01T00:16:33.525071394Z" level=info msg="loading plugin \"io.containerd.ttrpc.v1.pause\"..." runtime=io.containerd.runc.v2 type=io.containerd.ttrpc.v1 Nov 1 00:16:33.559977 systemd[1]: Started cri-containerd-9a3289fbcd1b03096a038247b25ec8abffb052c8f7c1ba3e04f6ef70c8f6160a.scope - libcontainer container 9a3289fbcd1b03096a038247b25ec8abffb052c8f7c1ba3e04f6ef70c8f6160a. Nov 1 00:16:33.575469 systemd-resolved[1332]: Failed to determine the local hostname and LLMNR/mDNS names, ignoring: No such device or address Nov 1 00:16:33.637612 containerd[1472]: time="2025-11-01T00:16:33.637546048Z" level=info msg="RunPodSandbox for &PodSandboxMetadata{Name:nfs-server-provisioner-0,Uid:58dd9312-22ca-438d-bfd6-c3f087753a3b,Namespace:default,Attempt:0,} returns sandbox id \"9a3289fbcd1b03096a038247b25ec8abffb052c8f7c1ba3e04f6ef70c8f6160a\"" Nov 1 00:16:33.639747 containerd[1472]: time="2025-11-01T00:16:33.639715856Z" level=info msg="PullImage \"registry.k8s.io/sig-storage/nfs-provisioner:v4.0.8\"" Nov 1 00:16:34.482157 kubelet[1755]: E1101 00:16:34.482054 1755 file_linux.go:61] "Unable to read config path" err="path does not exist, ignoring" path="/etc/kubernetes/manifests" Nov 1 00:16:35.482972 kubelet[1755]: E1101 00:16:35.482913 1755 file_linux.go:61] "Unable to read config path" err="path does not exist, ignoring" path="/etc/kubernetes/manifests" Nov 1 00:16:35.521137 systemd-networkd[1401]: vethb7e05971: Gained IPv6LL Nov 1 00:16:36.499139 kubelet[1755]: E1101 00:16:36.499033 1755 file_linux.go:61] "Unable to read config path" err="path does not exist, ignoring" path="/etc/kubernetes/manifests" Nov 1 00:16:36.785039 systemd[1]: var-lib-containerd-tmpmounts-containerd\x2dmount3993665446.mount: Deactivated successfully. Nov 1 00:16:37.499874 kubelet[1755]: E1101 00:16:37.499779 1755 file_linux.go:61] "Unable to read config path" err="path does not exist, ignoring" path="/etc/kubernetes/manifests" Nov 1 00:16:38.500633 kubelet[1755]: E1101 00:16:38.500558 1755 file_linux.go:61] "Unable to read config path" err="path does not exist, ignoring" path="/etc/kubernetes/manifests" Nov 1 00:16:39.358125 kubelet[1755]: E1101 00:16:39.358001 1755 file.go:104] "Unable to read config path" err="path does not exist, ignoring" path="/etc/kubernetes/manifests" Nov 1 00:16:39.500871 kubelet[1755]: E1101 00:16:39.500782 1755 file_linux.go:61] "Unable to read config path" err="path does not exist, ignoring" path="/etc/kubernetes/manifests" Nov 1 00:16:40.501207 kubelet[1755]: E1101 00:16:40.501130 1755 file_linux.go:61] "Unable to read config path" err="path does not exist, ignoring" path="/etc/kubernetes/manifests" Nov 1 00:16:40.799242 containerd[1472]: time="2025-11-01T00:16:40.799093062Z" level=info msg="ImageCreate event name:\"registry.k8s.io/sig-storage/nfs-provisioner:v4.0.8\" labels:{key:\"io.cri-containerd.image\" value:\"managed\"}" Nov 1 00:16:40.800076 containerd[1472]: time="2025-11-01T00:16:40.800040432Z" level=info msg="stop pulling image registry.k8s.io/sig-storage/nfs-provisioner:v4.0.8: active requests=0, bytes read=91039406" Nov 1 00:16:40.801384 containerd[1472]: time="2025-11-01T00:16:40.801338904Z" level=info msg="ImageCreate event name:\"sha256:fd0b16f70b66b72bcb2f91d556fa33eba02729c44ffc5f2c16130e7f9fbed3c4\" labels:{key:\"io.cri-containerd.image\" value:\"managed\"}" Nov 1 00:16:40.804423 containerd[1472]: time="2025-11-01T00:16:40.804385091Z" level=info msg="ImageCreate event name:\"registry.k8s.io/sig-storage/nfs-provisioner@sha256:c825f3d5e28bde099bd7a3daace28772d412c9157ad47fa752a9ad0baafc118d\" labels:{key:\"io.cri-containerd.image\" value:\"managed\"}" Nov 1 00:16:40.805611 containerd[1472]: time="2025-11-01T00:16:40.805564002Z" level=info msg="Pulled image \"registry.k8s.io/sig-storage/nfs-provisioner:v4.0.8\" with image id \"sha256:fd0b16f70b66b72bcb2f91d556fa33eba02729c44ffc5f2c16130e7f9fbed3c4\", repo tag \"registry.k8s.io/sig-storage/nfs-provisioner:v4.0.8\", repo digest \"registry.k8s.io/sig-storage/nfs-provisioner@sha256:c825f3d5e28bde099bd7a3daace28772d412c9157ad47fa752a9ad0baafc118d\", size \"91036984\" in 7.165789768s" Nov 1 00:16:40.805683 containerd[1472]: time="2025-11-01T00:16:40.805610498Z" level=info msg="PullImage \"registry.k8s.io/sig-storage/nfs-provisioner:v4.0.8\" returns image reference \"sha256:fd0b16f70b66b72bcb2f91d556fa33eba02729c44ffc5f2c16130e7f9fbed3c4\"" Nov 1 00:16:40.810451 containerd[1472]: time="2025-11-01T00:16:40.810402128Z" level=info msg="CreateContainer within sandbox \"9a3289fbcd1b03096a038247b25ec8abffb052c8f7c1ba3e04f6ef70c8f6160a\" for container &ContainerMetadata{Name:nfs-server-provisioner,Attempt:0,}" Nov 1 00:16:40.826760 containerd[1472]: time="2025-11-01T00:16:40.826712133Z" level=info msg="CreateContainer within sandbox \"9a3289fbcd1b03096a038247b25ec8abffb052c8f7c1ba3e04f6ef70c8f6160a\" for &ContainerMetadata{Name:nfs-server-provisioner,Attempt:0,} returns container id \"6af2c1c77bc7595bfa9dcdb5edade618506b9012e326d194ba44eed00a63a1e6\"" Nov 1 00:16:40.827485 containerd[1472]: time="2025-11-01T00:16:40.827454222Z" level=info msg="StartContainer for \"6af2c1c77bc7595bfa9dcdb5edade618506b9012e326d194ba44eed00a63a1e6\"" Nov 1 00:16:40.924065 systemd[1]: Started cri-containerd-6af2c1c77bc7595bfa9dcdb5edade618506b9012e326d194ba44eed00a63a1e6.scope - libcontainer container 6af2c1c77bc7595bfa9dcdb5edade618506b9012e326d194ba44eed00a63a1e6. Nov 1 00:16:40.999082 containerd[1472]: time="2025-11-01T00:16:40.999004853Z" level=info msg="StartContainer for \"6af2c1c77bc7595bfa9dcdb5edade618506b9012e326d194ba44eed00a63a1e6\" returns successfully" Nov 1 00:16:41.501949 kubelet[1755]: E1101 00:16:41.501846 1755 file_linux.go:61] "Unable to read config path" err="path does not exist, ignoring" path="/etc/kubernetes/manifests" Nov 1 00:16:42.502823 kubelet[1755]: E1101 00:16:42.502733 1755 file_linux.go:61] "Unable to read config path" err="path does not exist, ignoring" path="/etc/kubernetes/manifests" Nov 1 00:16:43.503941 kubelet[1755]: E1101 00:16:43.503853 1755 file_linux.go:61] "Unable to read config path" err="path does not exist, ignoring" path="/etc/kubernetes/manifests" Nov 1 00:16:44.504424 kubelet[1755]: E1101 00:16:44.504339 1755 file_linux.go:61] "Unable to read config path" err="path does not exist, ignoring" path="/etc/kubernetes/manifests" Nov 1 00:16:45.504778 kubelet[1755]: E1101 00:16:45.504655 1755 file_linux.go:61] "Unable to read config path" err="path does not exist, ignoring" path="/etc/kubernetes/manifests" Nov 1 00:16:46.505396 kubelet[1755]: E1101 00:16:46.505299 1755 file_linux.go:61] "Unable to read config path" err="path does not exist, ignoring" path="/etc/kubernetes/manifests" Nov 1 00:16:47.506008 kubelet[1755]: E1101 00:16:47.505925 1755 file_linux.go:61] "Unable to read config path" err="path does not exist, ignoring" path="/etc/kubernetes/manifests" Nov 1 00:16:48.506718 kubelet[1755]: E1101 00:16:48.506618 1755 file_linux.go:61] "Unable to read config path" err="path does not exist, ignoring" path="/etc/kubernetes/manifests" Nov 1 00:16:49.507138 kubelet[1755]: E1101 00:16:49.507059 1755 file_linux.go:61] "Unable to read config path" err="path does not exist, ignoring" path="/etc/kubernetes/manifests" Nov 1 00:16:50.507371 kubelet[1755]: E1101 00:16:50.507286 1755 file_linux.go:61] "Unable to read config path" err="path does not exist, ignoring" path="/etc/kubernetes/manifests" Nov 1 00:16:50.788705 kubelet[1755]: I1101 00:16:50.788456 1755 pod_startup_latency_tracker.go:104] "Observed pod startup duration" pod="default/nfs-server-provisioner-0" podStartSLOduration=10.618744832 podStartE2EDuration="17.788433586s" podCreationTimestamp="2025-11-01 00:16:33 +0000 UTC" firstStartedPulling="2025-11-01 00:16:33.639254083 +0000 UTC m=+34.677489421" lastFinishedPulling="2025-11-01 00:16:40.808942837 +0000 UTC m=+41.847178175" observedRunningTime="2025-11-01 00:16:41.196752768 +0000 UTC m=+42.234988457" watchObservedRunningTime="2025-11-01 00:16:50.788433586 +0000 UTC m=+51.826668924" Nov 1 00:16:50.796253 systemd[1]: Created slice kubepods-besteffort-pod3c6d1dcd_d830_4e81_b0a5_3a612423d213.slice - libcontainer container kubepods-besteffort-pod3c6d1dcd_d830_4e81_b0a5_3a612423d213.slice. Nov 1 00:16:51.239058 kubelet[1755]: I1101 00:16:51.238956 1755 reconciler_common.go:251] "operationExecutor.VerifyControllerAttachedVolume started for volume \"pvc-08149d5d-af01-482f-8c12-f4ce2260cd76\" (UniqueName: \"kubernetes.io/nfs/3c6d1dcd-d830-4e81-b0a5-3a612423d213-pvc-08149d5d-af01-482f-8c12-f4ce2260cd76\") pod \"test-pod-1\" (UID: \"3c6d1dcd-d830-4e81-b0a5-3a612423d213\") " pod="default/test-pod-1" Nov 1 00:16:51.239058 kubelet[1755]: I1101 00:16:51.239013 1755 reconciler_common.go:251] "operationExecutor.VerifyControllerAttachedVolume started for volume \"kube-api-access-9dwsm\" (UniqueName: \"kubernetes.io/projected/3c6d1dcd-d830-4e81-b0a5-3a612423d213-kube-api-access-9dwsm\") pod \"test-pod-1\" (UID: \"3c6d1dcd-d830-4e81-b0a5-3a612423d213\") " pod="default/test-pod-1" Nov 1 00:16:51.399871 kernel: FS-Cache: Loaded Nov 1 00:16:51.508190 kubelet[1755]: E1101 00:16:51.508007 1755 file_linux.go:61] "Unable to read config path" err="path does not exist, ignoring" path="/etc/kubernetes/manifests" Nov 1 00:16:51.532194 kernel: RPC: Registered named UNIX socket transport module. Nov 1 00:16:51.532357 kernel: RPC: Registered udp transport module. Nov 1 00:16:51.532385 kernel: RPC: Registered tcp transport module. Nov 1 00:16:51.577330 kernel: RPC: Registered tcp-with-tls transport module. Nov 1 00:16:51.579961 kernel: RPC: Registered tcp NFSv4.1 backchannel transport module. Nov 1 00:16:51.991298 kernel: NFS: Registering the id_resolver key type Nov 1 00:16:51.991464 kernel: Key type id_resolver registered Nov 1 00:16:51.991492 kernel: Key type id_legacy registered Nov 1 00:16:52.025953 nfsidmap[2851]: nss_getpwnam: name 'root@nfs-server-provisioner.default.svc.cluster.local' does not map into domain 'localdomain' Nov 1 00:16:52.031202 nfsidmap[2854]: nss_name_to_gid: name 'root@nfs-server-provisioner.default.svc.cluster.local' does not map into domain 'localdomain' Nov 1 00:16:52.299783 containerd[1472]: time="2025-11-01T00:16:52.299649666Z" level=info msg="RunPodSandbox for &PodSandboxMetadata{Name:test-pod-1,Uid:3c6d1dcd-d830-4e81-b0a5-3a612423d213,Namespace:default,Attempt:0,}" Nov 1 00:16:52.508581 kubelet[1755]: E1101 00:16:52.508515 1755 file_linux.go:61] "Unable to read config path" err="path does not exist, ignoring" path="/etc/kubernetes/manifests" Nov 1 00:16:53.165752 systemd-networkd[1401]: veth5e3091c8: Link UP Nov 1 00:16:53.169017 kernel: cni0: port 3(veth5e3091c8) entered blocking state Nov 1 00:16:53.169145 kernel: cni0: port 3(veth5e3091c8) entered disabled state Nov 1 00:16:53.169176 kernel: veth5e3091c8: entered allmulticast mode Nov 1 00:16:53.171711 kernel: veth5e3091c8: entered promiscuous mode Nov 1 00:16:53.182163 kernel: cni0: port 3(veth5e3091c8) entered blocking state Nov 1 00:16:53.182271 kernel: cni0: port 3(veth5e3091c8) entered forwarding state Nov 1 00:16:53.182484 systemd-networkd[1401]: veth5e3091c8: Gained carrier Nov 1 00:16:53.185748 containerd[1472]: map[string]interface {}{"cniVersion":"0.3.1", "hairpinMode":true, "ipMasq":false, "ipam":map[string]interface {}{"ranges":[][]map[string]interface {}{[]map[string]interface {}{map[string]interface {}{"subnet":"192.168.1.0/24"}}}, "routes":[]types.Route{types.Route{Dst:net.IPNet{IP:net.IP{0xc0, 0xa8, 0x0, 0x0}, Mask:net.IPMask{0xff, 0xff, 0x80, 0x0}}, GW:net.IP(nil)}}, "type":"host-local"}, "isDefaultGateway":true, "isGateway":true, "mtu":(*uint)(0xc000018938), "name":"cbr0", "type":"bridge"} Nov 1 00:16:53.185748 containerd[1472]: delegateAdd: netconf sent to delegate plugin: Nov 1 00:16:53.239104 containerd[1472]: {"cniVersion":"0.3.1","hairpinMode":true,"ipMasq":false,"ipam":{"ranges":[[{"subnet":"192.168.1.0/24"}]],"routes":[{"dst":"192.168.0.0/17"}],"type":"host-local"},"isDefaultGateway":true,"isGateway":true,"mtu":1450,"name":"cbr0","type":"bridge"}time="2025-11-01T00:16:53.238921602Z" level=info msg="loading plugin \"io.containerd.event.v1.publisher\"..." runtime=io.containerd.runc.v2 type=io.containerd.event.v1 Nov 1 00:16:53.239104 containerd[1472]: time="2025-11-01T00:16:53.239026228Z" level=info msg="loading plugin \"io.containerd.internal.v1.shutdown\"..." runtime=io.containerd.runc.v2 type=io.containerd.internal.v1 Nov 1 00:16:53.239104 containerd[1472]: time="2025-11-01T00:16:53.239045914Z" level=info msg="loading plugin \"io.containerd.ttrpc.v1.task\"..." runtime=io.containerd.runc.v2 type=io.containerd.ttrpc.v1 Nov 1 00:16:53.239381 containerd[1472]: time="2025-11-01T00:16:53.239219268Z" level=info msg="loading plugin \"io.containerd.ttrpc.v1.pause\"..." runtime=io.containerd.runc.v2 type=io.containerd.ttrpc.v1 Nov 1 00:16:53.348997 systemd[1]: Started cri-containerd-4aaa348bb0a65d331d16ce16fab3c133e960a9516974fe5f35f12b5e6f858e38.scope - libcontainer container 4aaa348bb0a65d331d16ce16fab3c133e960a9516974fe5f35f12b5e6f858e38. Nov 1 00:16:53.363559 systemd-resolved[1332]: Failed to determine the local hostname and LLMNR/mDNS names, ignoring: No such device or address Nov 1 00:16:53.470171 containerd[1472]: time="2025-11-01T00:16:53.470097326Z" level=info msg="RunPodSandbox for &PodSandboxMetadata{Name:test-pod-1,Uid:3c6d1dcd-d830-4e81-b0a5-3a612423d213,Namespace:default,Attempt:0,} returns sandbox id \"4aaa348bb0a65d331d16ce16fab3c133e960a9516974fe5f35f12b5e6f858e38\"" Nov 1 00:16:53.471864 containerd[1472]: time="2025-11-01T00:16:53.471769489Z" level=info msg="PullImage \"ghcr.io/flatcar/nginx:latest\"" Nov 1 00:16:53.509789 kubelet[1755]: E1101 00:16:53.509714 1755 file_linux.go:61] "Unable to read config path" err="path does not exist, ignoring" path="/etc/kubernetes/manifests" Nov 1 00:16:54.051855 containerd[1472]: time="2025-11-01T00:16:54.051740858Z" level=info msg="ImageUpdate event name:\"ghcr.io/flatcar/nginx:latest\" labels:{key:\"io.cri-containerd.image\" value:\"managed\"}" Nov 1 00:16:54.053236 containerd[1472]: time="2025-11-01T00:16:54.053181088Z" level=info msg="stop pulling image ghcr.io/flatcar/nginx:latest: active requests=0, bytes read=61" Nov 1 00:16:54.056785 containerd[1472]: time="2025-11-01T00:16:54.056707655Z" level=info msg="Pulled image \"ghcr.io/flatcar/nginx:latest\" with image id \"sha256:8d14817f00613fe76ef7459f977ad93e7b71a3948346b7ac4d50e35f3dd518e9\", repo tag \"ghcr.io/flatcar/nginx:latest\", repo digest \"ghcr.io/flatcar/nginx@sha256:0537df20ac7c5485a0f6b7bfb8e3fbbc8714fce070bab2a6344e5cadfba58d90\", size \"73311824\" in 584.841896ms" Nov 1 00:16:54.056785 containerd[1472]: time="2025-11-01T00:16:54.056766204Z" level=info msg="PullImage \"ghcr.io/flatcar/nginx:latest\" returns image reference \"sha256:8d14817f00613fe76ef7459f977ad93e7b71a3948346b7ac4d50e35f3dd518e9\"" Nov 1 00:16:54.060842 containerd[1472]: time="2025-11-01T00:16:54.060682529Z" level=info msg="CreateContainer within sandbox \"4aaa348bb0a65d331d16ce16fab3c133e960a9516974fe5f35f12b5e6f858e38\" for container &ContainerMetadata{Name:test,Attempt:0,}" Nov 1 00:16:54.086180 containerd[1472]: time="2025-11-01T00:16:54.086110425Z" level=info msg="CreateContainer within sandbox \"4aaa348bb0a65d331d16ce16fab3c133e960a9516974fe5f35f12b5e6f858e38\" for &ContainerMetadata{Name:test,Attempt:0,} returns container id \"df1976ffea78308550dc544f06188ca2e7e0a1727271b94ccf17f4d75faccecb\"" Nov 1 00:16:54.086939 containerd[1472]: time="2025-11-01T00:16:54.086894420Z" level=info msg="StartContainer for \"df1976ffea78308550dc544f06188ca2e7e0a1727271b94ccf17f4d75faccecb\"" Nov 1 00:16:54.124042 systemd[1]: Started cri-containerd-df1976ffea78308550dc544f06188ca2e7e0a1727271b94ccf17f4d75faccecb.scope - libcontainer container df1976ffea78308550dc544f06188ca2e7e0a1727271b94ccf17f4d75faccecb. Nov 1 00:16:54.185823 containerd[1472]: time="2025-11-01T00:16:54.185745042Z" level=info msg="StartContainer for \"df1976ffea78308550dc544f06188ca2e7e0a1727271b94ccf17f4d75faccecb\" returns successfully" Nov 1 00:16:54.230047 kubelet[1755]: I1101 00:16:54.229956 1755 pod_startup_latency_tracker.go:104] "Observed pod startup duration" pod="default/test-pod-1" podStartSLOduration=20.643145791 podStartE2EDuration="21.229928873s" podCreationTimestamp="2025-11-01 00:16:33 +0000 UTC" firstStartedPulling="2025-11-01 00:16:53.47133655 +0000 UTC m=+54.509571888" lastFinishedPulling="2025-11-01 00:16:54.058119632 +0000 UTC m=+55.096354970" observedRunningTime="2025-11-01 00:16:54.229915779 +0000 UTC m=+55.268151117" watchObservedRunningTime="2025-11-01 00:16:54.229928873 +0000 UTC m=+55.268164211" Nov 1 00:16:54.510269 kubelet[1755]: E1101 00:16:54.510180 1755 file_linux.go:61] "Unable to read config path" err="path does not exist, ignoring" path="/etc/kubernetes/manifests" Nov 1 00:16:55.105127 systemd-networkd[1401]: veth5e3091c8: Gained IPv6LL Nov 1 00:16:55.511014 kubelet[1755]: E1101 00:16:55.510911 1755 file_linux.go:61] "Unable to read config path" err="path does not exist, ignoring" path="/etc/kubernetes/manifests" Nov 1 00:16:56.511496 kubelet[1755]: E1101 00:16:56.511403 1755 file_linux.go:61] "Unable to read config path" err="path does not exist, ignoring" path="/etc/kubernetes/manifests"