Mar 21 12:11:57.076337 kernel: Booting Linux on physical CPU 0x0000000000 [0x413fd0c1] Mar 21 12:11:57.076360 kernel: Linux version 6.6.83-flatcar (build@pony-truck.infra.kinvolk.io) (aarch64-cros-linux-gnu-gcc (Gentoo Hardened 14.2.1_p20241221 p7) 14.2.1 20241221, GNU ld (Gentoo 2.44 p1) 2.44.0) #1 SMP PREEMPT Fri Mar 21 10:53:54 -00 2025 Mar 21 12:11:57.076370 kernel: KASLR enabled Mar 21 12:11:57.076376 kernel: efi: EFI v2.7 by EDK II Mar 21 12:11:57.076382 kernel: efi: SMBIOS 3.0=0xdced0000 MEMATTR=0xdbbae018 ACPI 2.0=0xd9b43018 RNG=0xd9b43a18 MEMRESERVE=0xd9b40218 Mar 21 12:11:57.076387 kernel: random: crng init done Mar 21 12:11:57.076394 kernel: secureboot: Secure boot disabled Mar 21 12:11:57.076400 kernel: ACPI: Early table checksum verification disabled Mar 21 12:11:57.076406 kernel: ACPI: RSDP 0x00000000D9B43018 000024 (v02 BOCHS ) Mar 21 12:11:57.076414 kernel: ACPI: XSDT 0x00000000D9B43F18 000064 (v01 BOCHS BXPC 00000001 01000013) Mar 21 12:11:57.076421 kernel: ACPI: FACP 0x00000000D9B43B18 000114 (v06 BOCHS BXPC 00000001 BXPC 00000001) Mar 21 12:11:57.076427 kernel: ACPI: DSDT 0x00000000D9B41018 0014A2 (v02 BOCHS BXPC 00000001 BXPC 00000001) Mar 21 12:11:57.076433 kernel: ACPI: APIC 0x00000000D9B43C98 0001A8 (v04 BOCHS BXPC 00000001 BXPC 00000001) Mar 21 12:11:57.076439 kernel: ACPI: PPTT 0x00000000D9B43098 00009C (v02 BOCHS BXPC 00000001 BXPC 00000001) Mar 21 12:11:57.076446 kernel: ACPI: GTDT 0x00000000D9B43818 000060 (v02 BOCHS BXPC 00000001 BXPC 00000001) Mar 21 12:11:57.076453 kernel: ACPI: MCFG 0x00000000D9B43A98 00003C (v01 BOCHS BXPC 00000001 BXPC 00000001) Mar 21 12:11:57.076460 kernel: ACPI: SPCR 0x00000000D9B43918 000050 (v02 BOCHS BXPC 00000001 BXPC 00000001) Mar 21 12:11:57.076466 kernel: ACPI: DBG2 0x00000000D9B43998 000057 (v00 BOCHS BXPC 00000001 BXPC 00000001) Mar 21 12:11:57.076472 kernel: ACPI: IORT 0x00000000D9B43198 000080 (v03 BOCHS BXPC 00000001 BXPC 00000001) Mar 21 12:11:57.076479 kernel: ACPI: SPCR: console: pl011,mmio,0x9000000,9600 Mar 21 12:11:57.076486 kernel: NUMA: Failed to initialise from firmware Mar 21 12:11:57.076492 kernel: NUMA: Faking a node at [mem 0x0000000040000000-0x00000000dcffffff] Mar 21 12:11:57.076498 kernel: NUMA: NODE_DATA [mem 0xdc957800-0xdc95cfff] Mar 21 12:11:57.076505 kernel: Zone ranges: Mar 21 12:11:57.076511 kernel: DMA [mem 0x0000000040000000-0x00000000dcffffff] Mar 21 12:11:57.076519 kernel: DMA32 empty Mar 21 12:11:57.076525 kernel: Normal empty Mar 21 12:11:57.076531 kernel: Movable zone start for each node Mar 21 12:11:57.076538 kernel: Early memory node ranges Mar 21 12:11:57.076545 kernel: node 0: [mem 0x0000000040000000-0x00000000d967ffff] Mar 21 12:11:57.076551 kernel: node 0: [mem 0x00000000d9680000-0x00000000d968ffff] Mar 21 12:11:57.076558 kernel: node 0: [mem 0x00000000d9690000-0x00000000d976ffff] Mar 21 12:11:57.076564 kernel: node 0: [mem 0x00000000d9770000-0x00000000d9b3ffff] Mar 21 12:11:57.076570 kernel: node 0: [mem 0x00000000d9b40000-0x00000000dce1ffff] Mar 21 12:11:57.076576 kernel: node 0: [mem 0x00000000dce20000-0x00000000dceaffff] Mar 21 12:11:57.076582 kernel: node 0: [mem 0x00000000dceb0000-0x00000000dcebffff] Mar 21 12:11:57.076589 kernel: node 0: [mem 0x00000000dcec0000-0x00000000dcfdffff] Mar 21 12:11:57.076596 kernel: node 0: [mem 0x00000000dcfe0000-0x00000000dcffffff] Mar 21 12:11:57.076603 kernel: Initmem setup node 0 [mem 0x0000000040000000-0x00000000dcffffff] Mar 21 12:11:57.076609 kernel: On node 0, zone DMA: 12288 pages in unavailable ranges Mar 21 12:11:57.076618 kernel: psci: probing for conduit method from ACPI. Mar 21 12:11:57.076625 kernel: psci: PSCIv1.1 detected in firmware. Mar 21 12:11:57.076631 kernel: psci: Using standard PSCI v0.2 function IDs Mar 21 12:11:57.076639 kernel: psci: Trusted OS migration not required Mar 21 12:11:57.076646 kernel: psci: SMC Calling Convention v1.1 Mar 21 12:11:57.076652 kernel: smccc: KVM: hypervisor services detected (0x00000000 0x00000000 0x00000000 0x00000003) Mar 21 12:11:57.076659 kernel: percpu: Embedded 31 pages/cpu s86696 r8192 d32088 u126976 Mar 21 12:11:57.076666 kernel: pcpu-alloc: s86696 r8192 d32088 u126976 alloc=31*4096 Mar 21 12:11:57.076673 kernel: pcpu-alloc: [0] 0 [0] 1 [0] 2 [0] 3 Mar 21 12:11:57.076679 kernel: Detected PIPT I-cache on CPU0 Mar 21 12:11:57.076686 kernel: CPU features: detected: GIC system register CPU interface Mar 21 12:11:57.076693 kernel: CPU features: detected: Hardware dirty bit management Mar 21 12:11:57.076700 kernel: CPU features: detected: Spectre-v4 Mar 21 12:11:57.076708 kernel: CPU features: detected: Spectre-BHB Mar 21 12:11:57.076714 kernel: CPU features: kernel page table isolation forced ON by KASLR Mar 21 12:11:57.076721 kernel: CPU features: detected: Kernel page table isolation (KPTI) Mar 21 12:11:57.076735 kernel: CPU features: detected: ARM erratum 1418040 Mar 21 12:11:57.076754 kernel: CPU features: detected: SSBS not fully self-synchronizing Mar 21 12:11:57.076761 kernel: alternatives: applying boot alternatives Mar 21 12:11:57.076769 kernel: Kernel command line: BOOT_IMAGE=/flatcar/vmlinuz-a mount.usr=/dev/mapper/usr verity.usr=PARTUUID=7130c94a-213a-4e5a-8e26-6cce9662f132 rootflags=rw mount.usrflags=ro consoleblank=0 root=LABEL=ROOT console=ttyS0,115200 flatcar.first_boot=detected acpi=force verity.usrhash=93cb17f03b776356c0810b716fff0c7c2012572bbe395c702f6873d17674684f Mar 21 12:11:57.076777 kernel: Unknown kernel command line parameters "BOOT_IMAGE=/flatcar/vmlinuz-a", will be passed to user space. Mar 21 12:11:57.076783 kernel: Dentry cache hash table entries: 524288 (order: 10, 4194304 bytes, linear) Mar 21 12:11:57.076790 kernel: Inode-cache hash table entries: 262144 (order: 9, 2097152 bytes, linear) Mar 21 12:11:57.076797 kernel: Fallback order for Node 0: 0 Mar 21 12:11:57.076811 kernel: Built 1 zonelists, mobility grouping on. Total pages: 633024 Mar 21 12:11:57.076820 kernel: Policy zone: DMA Mar 21 12:11:57.076827 kernel: mem auto-init: stack:off, heap alloc:off, heap free:off Mar 21 12:11:57.076834 kernel: software IO TLB: area num 4. Mar 21 12:11:57.076840 kernel: software IO TLB: mapped [mem 0x00000000d2e00000-0x00000000d6e00000] (64MB) Mar 21 12:11:57.076848 kernel: Memory: 2387408K/2572288K available (10304K kernel code, 2186K rwdata, 8096K rodata, 38464K init, 897K bss, 184880K reserved, 0K cma-reserved) Mar 21 12:11:57.076854 kernel: SLUB: HWalign=64, Order=0-3, MinObjects=0, CPUs=4, Nodes=1 Mar 21 12:11:57.076862 kernel: rcu: Preemptible hierarchical RCU implementation. Mar 21 12:11:57.076869 kernel: rcu: RCU event tracing is enabled. Mar 21 12:11:57.076876 kernel: rcu: RCU restricting CPUs from NR_CPUS=512 to nr_cpu_ids=4. Mar 21 12:11:57.076883 kernel: Trampoline variant of Tasks RCU enabled. Mar 21 12:11:57.076889 kernel: Tracing variant of Tasks RCU enabled. Mar 21 12:11:57.076898 kernel: rcu: RCU calculated value of scheduler-enlistment delay is 100 jiffies. Mar 21 12:11:57.076905 kernel: rcu: Adjusting geometry for rcu_fanout_leaf=16, nr_cpu_ids=4 Mar 21 12:11:57.076912 kernel: NR_IRQS: 64, nr_irqs: 64, preallocated irqs: 0 Mar 21 12:11:57.076918 kernel: GICv3: 256 SPIs implemented Mar 21 12:11:57.076925 kernel: GICv3: 0 Extended SPIs implemented Mar 21 12:11:57.076932 kernel: Root IRQ handler: gic_handle_irq Mar 21 12:11:57.076938 kernel: GICv3: GICv3 features: 16 PPIs, DirectLPI Mar 21 12:11:57.076945 kernel: GICv3: CPU0: found redistributor 0 region 0:0x00000000080a0000 Mar 21 12:11:57.076952 kernel: ITS [mem 0x08080000-0x0809ffff] Mar 21 12:11:57.076958 kernel: ITS@0x0000000008080000: allocated 8192 Devices @400c0000 (indirect, esz 8, psz 64K, shr 1) Mar 21 12:11:57.076965 kernel: ITS@0x0000000008080000: allocated 8192 Interrupt Collections @400d0000 (flat, esz 8, psz 64K, shr 1) Mar 21 12:11:57.076974 kernel: GICv3: using LPI property table @0x00000000400f0000 Mar 21 12:11:57.076981 kernel: GICv3: CPU0: using allocated LPI pending table @0x0000000040100000 Mar 21 12:11:57.076991 kernel: rcu: srcu_init: Setting srcu_struct sizes based on contention. Mar 21 12:11:57.077000 kernel: arch_timer: Enabling local workaround for ARM erratum 1418040 Mar 21 12:11:57.077007 kernel: arch_timer: cp15 timer(s) running at 25.00MHz (virt). Mar 21 12:11:57.077014 kernel: clocksource: arch_sys_counter: mask: 0xffffffffffffff max_cycles: 0x5c40939b5, max_idle_ns: 440795202646 ns Mar 21 12:11:57.077021 kernel: sched_clock: 56 bits at 25MHz, resolution 40ns, wraps every 4398046511100ns Mar 21 12:11:57.077028 kernel: arm-pv: using stolen time PV Mar 21 12:11:57.077035 kernel: Console: colour dummy device 80x25 Mar 21 12:11:57.077042 kernel: ACPI: Core revision 20230628 Mar 21 12:11:57.077050 kernel: Calibrating delay loop (skipped), value calculated using timer frequency.. 50.00 BogoMIPS (lpj=25000) Mar 21 12:11:57.077059 kernel: pid_max: default: 32768 minimum: 301 Mar 21 12:11:57.077066 kernel: LSM: initializing lsm=lockdown,capability,landlock,selinux,integrity Mar 21 12:11:57.077073 kernel: landlock: Up and running. Mar 21 12:11:57.077080 kernel: SELinux: Initializing. Mar 21 12:11:57.077087 kernel: Mount-cache hash table entries: 8192 (order: 4, 65536 bytes, linear) Mar 21 12:11:57.077094 kernel: Mountpoint-cache hash table entries: 8192 (order: 4, 65536 bytes, linear) Mar 21 12:11:57.077100 kernel: RCU Tasks: Setting shift to 2 and lim to 1 rcu_task_cb_adjust=1 rcu_task_cpu_ids=4. Mar 21 12:11:57.077107 kernel: RCU Tasks Trace: Setting shift to 2 and lim to 1 rcu_task_cb_adjust=1 rcu_task_cpu_ids=4. Mar 21 12:11:57.077114 kernel: rcu: Hierarchical SRCU implementation. Mar 21 12:11:57.077122 kernel: rcu: Max phase no-delay instances is 400. Mar 21 12:11:57.077129 kernel: Platform MSI: ITS@0x8080000 domain created Mar 21 12:11:57.077135 kernel: PCI/MSI: ITS@0x8080000 domain created Mar 21 12:11:57.077142 kernel: Remapping and enabling EFI services. Mar 21 12:11:57.077149 kernel: smp: Bringing up secondary CPUs ... Mar 21 12:11:57.077155 kernel: Detected PIPT I-cache on CPU1 Mar 21 12:11:57.077162 kernel: GICv3: CPU1: found redistributor 1 region 0:0x00000000080c0000 Mar 21 12:11:57.077169 kernel: GICv3: CPU1: using allocated LPI pending table @0x0000000040110000 Mar 21 12:11:57.077176 kernel: arch_timer: Enabling local workaround for ARM erratum 1418040 Mar 21 12:11:57.077184 kernel: CPU1: Booted secondary processor 0x0000000001 [0x413fd0c1] Mar 21 12:11:57.077191 kernel: Detected PIPT I-cache on CPU2 Mar 21 12:11:57.077203 kernel: GICv3: CPU2: found redistributor 2 region 0:0x00000000080e0000 Mar 21 12:11:57.077212 kernel: GICv3: CPU2: using allocated LPI pending table @0x0000000040120000 Mar 21 12:11:57.077219 kernel: arch_timer: Enabling local workaround for ARM erratum 1418040 Mar 21 12:11:57.077226 kernel: CPU2: Booted secondary processor 0x0000000002 [0x413fd0c1] Mar 21 12:11:57.077233 kernel: Detected PIPT I-cache on CPU3 Mar 21 12:11:57.077240 kernel: GICv3: CPU3: found redistributor 3 region 0:0x0000000008100000 Mar 21 12:11:57.077247 kernel: GICv3: CPU3: using allocated LPI pending table @0x0000000040130000 Mar 21 12:11:57.077255 kernel: arch_timer: Enabling local workaround for ARM erratum 1418040 Mar 21 12:11:57.077262 kernel: CPU3: Booted secondary processor 0x0000000003 [0x413fd0c1] Mar 21 12:11:57.077269 kernel: smp: Brought up 1 node, 4 CPUs Mar 21 12:11:57.077276 kernel: SMP: Total of 4 processors activated. Mar 21 12:11:57.077284 kernel: CPU features: detected: 32-bit EL0 Support Mar 21 12:11:57.077291 kernel: CPU features: detected: Data cache clean to the PoU not required for I/D coherence Mar 21 12:11:57.077298 kernel: CPU features: detected: Common not Private translations Mar 21 12:11:57.077305 kernel: CPU features: detected: CRC32 instructions Mar 21 12:11:57.077314 kernel: CPU features: detected: Enhanced Virtualization Traps Mar 21 12:11:57.077321 kernel: CPU features: detected: RCpc load-acquire (LDAPR) Mar 21 12:11:57.077328 kernel: CPU features: detected: LSE atomic instructions Mar 21 12:11:57.077335 kernel: CPU features: detected: Privileged Access Never Mar 21 12:11:57.077342 kernel: CPU features: detected: RAS Extension Support Mar 21 12:11:57.077349 kernel: CPU features: detected: Speculative Store Bypassing Safe (SSBS) Mar 21 12:11:57.077356 kernel: CPU: All CPU(s) started at EL1 Mar 21 12:11:57.077362 kernel: alternatives: applying system-wide alternatives Mar 21 12:11:57.077369 kernel: devtmpfs: initialized Mar 21 12:11:57.077376 kernel: clocksource: jiffies: mask: 0xffffffff max_cycles: 0xffffffff, max_idle_ns: 1911260446275000 ns Mar 21 12:11:57.077385 kernel: futex hash table entries: 1024 (order: 4, 65536 bytes, linear) Mar 21 12:11:57.077392 kernel: pinctrl core: initialized pinctrl subsystem Mar 21 12:11:57.077399 kernel: SMBIOS 3.0.0 present. Mar 21 12:11:57.077405 kernel: DMI: QEMU KVM Virtual Machine, BIOS unknown 02/02/2022 Mar 21 12:11:57.077412 kernel: NET: Registered PF_NETLINK/PF_ROUTE protocol family Mar 21 12:11:57.077419 kernel: DMA: preallocated 512 KiB GFP_KERNEL pool for atomic allocations Mar 21 12:11:57.077426 kernel: DMA: preallocated 512 KiB GFP_KERNEL|GFP_DMA pool for atomic allocations Mar 21 12:11:57.077434 kernel: DMA: preallocated 512 KiB GFP_KERNEL|GFP_DMA32 pool for atomic allocations Mar 21 12:11:57.077443 kernel: audit: initializing netlink subsys (disabled) Mar 21 12:11:57.077451 kernel: audit: type=2000 audit(0.018:1): state=initialized audit_enabled=0 res=1 Mar 21 12:11:57.077458 kernel: thermal_sys: Registered thermal governor 'step_wise' Mar 21 12:11:57.077465 kernel: cpuidle: using governor menu Mar 21 12:11:57.077473 kernel: hw-breakpoint: found 6 breakpoint and 4 watchpoint registers. Mar 21 12:11:57.077480 kernel: ASID allocator initialised with 32768 entries Mar 21 12:11:57.077487 kernel: acpiphp: ACPI Hot Plug PCI Controller Driver version: 0.5 Mar 21 12:11:57.077494 kernel: Serial: AMBA PL011 UART driver Mar 21 12:11:57.077501 kernel: Modules: 2G module region forced by RANDOMIZE_MODULE_REGION_FULL Mar 21 12:11:57.077509 kernel: Modules: 0 pages in range for non-PLT usage Mar 21 12:11:57.077516 kernel: Modules: 509248 pages in range for PLT usage Mar 21 12:11:57.077524 kernel: HugeTLB: registered 1.00 GiB page size, pre-allocated 0 pages Mar 21 12:11:57.077531 kernel: HugeTLB: 0 KiB vmemmap can be freed for a 1.00 GiB page Mar 21 12:11:57.077538 kernel: HugeTLB: registered 32.0 MiB page size, pre-allocated 0 pages Mar 21 12:11:57.077545 kernel: HugeTLB: 0 KiB vmemmap can be freed for a 32.0 MiB page Mar 21 12:11:57.077551 kernel: HugeTLB: registered 2.00 MiB page size, pre-allocated 0 pages Mar 21 12:11:57.077559 kernel: HugeTLB: 0 KiB vmemmap can be freed for a 2.00 MiB page Mar 21 12:11:57.077566 kernel: HugeTLB: registered 64.0 KiB page size, pre-allocated 0 pages Mar 21 12:11:57.077573 kernel: HugeTLB: 0 KiB vmemmap can be freed for a 64.0 KiB page Mar 21 12:11:57.077582 kernel: ACPI: Added _OSI(Module Device) Mar 21 12:11:57.077590 kernel: ACPI: Added _OSI(Processor Device) Mar 21 12:11:57.077597 kernel: ACPI: Added _OSI(3.0 _SCP Extensions) Mar 21 12:11:57.077604 kernel: ACPI: Added _OSI(Processor Aggregator Device) Mar 21 12:11:57.077612 kernel: ACPI: 1 ACPI AML tables successfully acquired and loaded Mar 21 12:11:57.077620 kernel: ACPI: Interpreter enabled Mar 21 12:11:57.077627 kernel: ACPI: Using GIC for interrupt routing Mar 21 12:11:57.077634 kernel: ACPI: MCFG table detected, 1 entries Mar 21 12:11:57.077642 kernel: ARMH0011:00: ttyAMA0 at MMIO 0x9000000 (irq = 12, base_baud = 0) is a SBSA Mar 21 12:11:57.077650 kernel: printk: console [ttyAMA0] enabled Mar 21 12:11:57.077658 kernel: ACPI: PCI Root Bridge [PCI0] (domain 0000 [bus 00-ff]) Mar 21 12:11:57.077852 kernel: acpi PNP0A08:00: _OSC: OS supports [ExtendedConfig ASPM ClockPM Segments MSI HPX-Type3] Mar 21 12:11:57.077937 kernel: acpi PNP0A08:00: _OSC: platform does not support [LTR] Mar 21 12:11:57.078016 kernel: acpi PNP0A08:00: _OSC: OS now controls [PCIeHotplug PME AER PCIeCapability] Mar 21 12:11:57.078084 kernel: acpi PNP0A08:00: ECAM area [mem 0x4010000000-0x401fffffff] reserved by PNP0C02:00 Mar 21 12:11:57.078149 kernel: acpi PNP0A08:00: ECAM at [mem 0x4010000000-0x401fffffff] for [bus 00-ff] Mar 21 12:11:57.078162 kernel: ACPI: Remapped I/O 0x000000003eff0000 to [io 0x0000-0xffff window] Mar 21 12:11:57.078169 kernel: PCI host bridge to bus 0000:00 Mar 21 12:11:57.078245 kernel: pci_bus 0000:00: root bus resource [mem 0x10000000-0x3efeffff window] Mar 21 12:11:57.078311 kernel: pci_bus 0000:00: root bus resource [io 0x0000-0xffff window] Mar 21 12:11:57.078373 kernel: pci_bus 0000:00: root bus resource [mem 0x8000000000-0xffffffffff window] Mar 21 12:11:57.078433 kernel: pci_bus 0000:00: root bus resource [bus 00-ff] Mar 21 12:11:57.078517 kernel: pci 0000:00:00.0: [1b36:0008] type 00 class 0x060000 Mar 21 12:11:57.078599 kernel: pci 0000:00:01.0: [1af4:1005] type 00 class 0x00ff00 Mar 21 12:11:57.078669 kernel: pci 0000:00:01.0: reg 0x10: [io 0x0000-0x001f] Mar 21 12:11:57.078761 kernel: pci 0000:00:01.0: reg 0x14: [mem 0x10000000-0x10000fff] Mar 21 12:11:57.078839 kernel: pci 0000:00:01.0: reg 0x20: [mem 0x8000000000-0x8000003fff 64bit pref] Mar 21 12:11:57.078913 kernel: pci 0000:00:01.0: BAR 4: assigned [mem 0x8000000000-0x8000003fff 64bit pref] Mar 21 12:11:57.078979 kernel: pci 0000:00:01.0: BAR 1: assigned [mem 0x10000000-0x10000fff] Mar 21 12:11:57.079048 kernel: pci 0000:00:01.0: BAR 0: assigned [io 0x1000-0x101f] Mar 21 12:11:57.079132 kernel: pci_bus 0000:00: resource 4 [mem 0x10000000-0x3efeffff window] Mar 21 12:11:57.079206 kernel: pci_bus 0000:00: resource 5 [io 0x0000-0xffff window] Mar 21 12:11:57.079293 kernel: pci_bus 0000:00: resource 6 [mem 0x8000000000-0xffffffffff window] Mar 21 12:11:57.079303 kernel: ACPI: PCI: Interrupt link GSI0 configured for IRQ 35 Mar 21 12:11:57.079311 kernel: ACPI: PCI: Interrupt link GSI1 configured for IRQ 36 Mar 21 12:11:57.079318 kernel: ACPI: PCI: Interrupt link GSI2 configured for IRQ 37 Mar 21 12:11:57.079326 kernel: ACPI: PCI: Interrupt link GSI3 configured for IRQ 38 Mar 21 12:11:57.079333 kernel: iommu: Default domain type: Translated Mar 21 12:11:57.079343 kernel: iommu: DMA domain TLB invalidation policy: strict mode Mar 21 12:11:57.079350 kernel: efivars: Registered efivars operations Mar 21 12:11:57.079357 kernel: vgaarb: loaded Mar 21 12:11:57.079364 kernel: clocksource: Switched to clocksource arch_sys_counter Mar 21 12:11:57.079372 kernel: VFS: Disk quotas dquot_6.6.0 Mar 21 12:11:57.079379 kernel: VFS: Dquot-cache hash table entries: 512 (order 0, 4096 bytes) Mar 21 12:11:57.079385 kernel: pnp: PnP ACPI init Mar 21 12:11:57.079462 kernel: system 00:00: [mem 0x4010000000-0x401fffffff window] could not be reserved Mar 21 12:11:57.079474 kernel: pnp: PnP ACPI: found 1 devices Mar 21 12:11:57.079481 kernel: NET: Registered PF_INET protocol family Mar 21 12:11:57.079488 kernel: IP idents hash table entries: 65536 (order: 7, 524288 bytes, linear) Mar 21 12:11:57.079496 kernel: tcp_listen_portaddr_hash hash table entries: 2048 (order: 3, 32768 bytes, linear) Mar 21 12:11:57.079503 kernel: Table-perturb hash table entries: 65536 (order: 6, 262144 bytes, linear) Mar 21 12:11:57.079511 kernel: TCP established hash table entries: 32768 (order: 6, 262144 bytes, linear) Mar 21 12:11:57.079518 kernel: TCP bind hash table entries: 32768 (order: 8, 1048576 bytes, linear) Mar 21 12:11:57.079526 kernel: TCP: Hash tables configured (established 32768 bind 32768) Mar 21 12:11:57.079533 kernel: UDP hash table entries: 2048 (order: 4, 65536 bytes, linear) Mar 21 12:11:57.079542 kernel: UDP-Lite hash table entries: 2048 (order: 4, 65536 bytes, linear) Mar 21 12:11:57.079550 kernel: NET: Registered PF_UNIX/PF_LOCAL protocol family Mar 21 12:11:57.079557 kernel: PCI: CLS 0 bytes, default 64 Mar 21 12:11:57.079565 kernel: kvm [1]: HYP mode not available Mar 21 12:11:57.079572 kernel: Initialise system trusted keyrings Mar 21 12:11:57.079579 kernel: workingset: timestamp_bits=39 max_order=20 bucket_order=0 Mar 21 12:11:57.079586 kernel: Key type asymmetric registered Mar 21 12:11:57.079593 kernel: Asymmetric key parser 'x509' registered Mar 21 12:11:57.079600 kernel: Block layer SCSI generic (bsg) driver version 0.4 loaded (major 250) Mar 21 12:11:57.079609 kernel: io scheduler mq-deadline registered Mar 21 12:11:57.079616 kernel: io scheduler kyber registered Mar 21 12:11:57.079623 kernel: io scheduler bfq registered Mar 21 12:11:57.079630 kernel: input: Power Button as /devices/LNXSYSTM:00/LNXSYBUS:00/PNP0C0C:00/input/input0 Mar 21 12:11:57.079637 kernel: ACPI: button: Power Button [PWRB] Mar 21 12:11:57.079644 kernel: ACPI: \_SB_.PCI0.GSI1: Enabled at IRQ 36 Mar 21 12:11:57.079712 kernel: virtio-pci 0000:00:01.0: enabling device (0005 -> 0007) Mar 21 12:11:57.079722 kernel: Serial: 8250/16550 driver, 4 ports, IRQ sharing enabled Mar 21 12:11:57.079749 kernel: thunder_xcv, ver 1.0 Mar 21 12:11:57.079761 kernel: thunder_bgx, ver 1.0 Mar 21 12:11:57.079768 kernel: nicpf, ver 1.0 Mar 21 12:11:57.079775 kernel: nicvf, ver 1.0 Mar 21 12:11:57.079878 kernel: rtc-efi rtc-efi.0: registered as rtc0 Mar 21 12:11:57.079958 kernel: rtc-efi rtc-efi.0: setting system clock to 2025-03-21T12:11:56 UTC (1742559116) Mar 21 12:11:57.079967 kernel: hid: raw HID events driver (C) Jiri Kosina Mar 21 12:11:57.079975 kernel: hw perfevents: enabled with armv8_pmuv3_0 PMU driver, 7 counters available Mar 21 12:11:57.079982 kernel: watchdog: Delayed init of the lockup detector failed: -19 Mar 21 12:11:57.079992 kernel: watchdog: Hard watchdog permanently disabled Mar 21 12:11:57.079999 kernel: NET: Registered PF_INET6 protocol family Mar 21 12:11:57.080006 kernel: Segment Routing with IPv6 Mar 21 12:11:57.080013 kernel: In-situ OAM (IOAM) with IPv6 Mar 21 12:11:57.080021 kernel: NET: Registered PF_PACKET protocol family Mar 21 12:11:57.080028 kernel: Key type dns_resolver registered Mar 21 12:11:57.080035 kernel: registered taskstats version 1 Mar 21 12:11:57.080042 kernel: Loading compiled-in X.509 certificates Mar 21 12:11:57.080049 kernel: Loaded X.509 cert 'Kinvolk GmbH: Module signing key for 6.6.83-flatcar: 5eb113f0b3321dedaccf2566eff1e4f54032526e' Mar 21 12:11:57.080057 kernel: Key type .fscrypt registered Mar 21 12:11:57.080065 kernel: Key type fscrypt-provisioning registered Mar 21 12:11:57.080073 kernel: ima: No TPM chip found, activating TPM-bypass! Mar 21 12:11:57.080080 kernel: ima: Allocated hash algorithm: sha1 Mar 21 12:11:57.080087 kernel: ima: No architecture policies found Mar 21 12:11:57.080095 kernel: alg: No test for fips(ansi_cprng) (fips_ansi_cprng) Mar 21 12:11:57.080102 kernel: clk: Disabling unused clocks Mar 21 12:11:57.080110 kernel: Freeing unused kernel memory: 38464K Mar 21 12:11:57.080116 kernel: Run /init as init process Mar 21 12:11:57.080124 kernel: with arguments: Mar 21 12:11:57.080131 kernel: /init Mar 21 12:11:57.080138 kernel: with environment: Mar 21 12:11:57.080145 kernel: HOME=/ Mar 21 12:11:57.080152 kernel: TERM=linux Mar 21 12:11:57.080158 kernel: BOOT_IMAGE=/flatcar/vmlinuz-a Mar 21 12:11:57.080166 systemd[1]: Successfully made /usr/ read-only. Mar 21 12:11:57.080176 systemd[1]: systemd 256.8 running in system mode (+PAM +AUDIT +SELINUX -APPARMOR +IMA +SMACK +SECCOMP +GCRYPT -GNUTLS +OPENSSL -ACL +BLKID +CURL +ELFUTILS -FIDO2 +IDN2 -IDN +IPTC +KMOD +LIBCRYPTSETUP +LIBCRYPTSETUP_PLUGINS +LIBFDISK +PCRE2 -PWQUALITY -P11KIT -QRENCODE +TPM2 +BZIP2 +LZ4 +XZ +ZLIB +ZSTD -BPF_FRAMEWORK -XKBCOMMON +UTMP -SYSVINIT +LIBARCHIVE) Mar 21 12:11:57.080185 systemd[1]: Detected virtualization kvm. Mar 21 12:11:57.080193 systemd[1]: Detected architecture arm64. Mar 21 12:11:57.080200 systemd[1]: Running in initrd. Mar 21 12:11:57.080208 systemd[1]: No hostname configured, using default hostname. Mar 21 12:11:57.080217 systemd[1]: Hostname set to . Mar 21 12:11:57.080225 systemd[1]: Initializing machine ID from VM UUID. Mar 21 12:11:57.080233 systemd[1]: Queued start job for default target initrd.target. Mar 21 12:11:57.080241 systemd[1]: Started clevis-luks-askpass.path - Forward Password Requests to Clevis Directory Watch. Mar 21 12:11:57.080251 systemd[1]: Started systemd-ask-password-console.path - Dispatch Password Requests to Console Directory Watch. Mar 21 12:11:57.080259 systemd[1]: Expecting device dev-disk-by\x2dlabel-EFI\x2dSYSTEM.device - /dev/disk/by-label/EFI-SYSTEM... Mar 21 12:11:57.080267 systemd[1]: Expecting device dev-disk-by\x2dlabel-OEM.device - /dev/disk/by-label/OEM... Mar 21 12:11:57.080275 systemd[1]: Expecting device dev-disk-by\x2dlabel-ROOT.device - /dev/disk/by-label/ROOT... Mar 21 12:11:57.080284 systemd[1]: Expecting device dev-disk-by\x2dpartlabel-USR\x2dA.device - /dev/disk/by-partlabel/USR-A... Mar 21 12:11:57.080294 systemd[1]: Expecting device dev-disk-by\x2dpartuuid-7130c94a\x2d213a\x2d4e5a\x2d8e26\x2d6cce9662f132.device - /dev/disk/by-partuuid/7130c94a-213a-4e5a-8e26-6cce9662f132... Mar 21 12:11:57.080303 systemd[1]: Expecting device dev-mapper-usr.device - /dev/mapper/usr... Mar 21 12:11:57.080312 systemd[1]: Reached target cryptsetup-pre.target - Local Encrypted Volumes (Pre). Mar 21 12:11:57.080319 systemd[1]: Reached target cryptsetup.target - Local Encrypted Volumes. Mar 21 12:11:57.080327 systemd[1]: Reached target paths.target - Path Units. Mar 21 12:11:57.080335 systemd[1]: Reached target slices.target - Slice Units. Mar 21 12:11:57.080343 systemd[1]: Reached target swap.target - Swaps. Mar 21 12:11:57.080351 systemd[1]: Reached target timers.target - Timer Units. Mar 21 12:11:57.080359 systemd[1]: Listening on iscsid.socket - Open-iSCSI iscsid Socket. Mar 21 12:11:57.080367 systemd[1]: Listening on iscsiuio.socket - Open-iSCSI iscsiuio Socket. Mar 21 12:11:57.080377 systemd[1]: Listening on systemd-journald-dev-log.socket - Journal Socket (/dev/log). Mar 21 12:11:57.080385 systemd[1]: Listening on systemd-journald.socket - Journal Sockets. Mar 21 12:11:57.080393 systemd[1]: Listening on systemd-networkd.socket - Network Service Netlink Socket. Mar 21 12:11:57.080401 systemd[1]: Listening on systemd-udevd-control.socket - udev Control Socket. Mar 21 12:11:57.080410 systemd[1]: Listening on systemd-udevd-kernel.socket - udev Kernel Socket. Mar 21 12:11:57.080418 systemd[1]: Reached target sockets.target - Socket Units. Mar 21 12:11:57.080426 systemd[1]: Starting ignition-setup-pre.service - Ignition env setup... Mar 21 12:11:57.080434 systemd[1]: Starting kmod-static-nodes.service - Create List of Static Device Nodes... Mar 21 12:11:57.080444 systemd[1]: Finished network-cleanup.service - Network Cleanup. Mar 21 12:11:57.080451 systemd[1]: Starting systemd-fsck-usr.service... Mar 21 12:11:57.080459 systemd[1]: Starting systemd-journald.service - Journal Service... Mar 21 12:11:57.080467 systemd[1]: Starting systemd-modules-load.service - Load Kernel Modules... Mar 21 12:11:57.080475 systemd[1]: Starting systemd-vconsole-setup.service - Virtual Console Setup... Mar 21 12:11:57.080483 systemd[1]: Finished kmod-static-nodes.service - Create List of Static Device Nodes. Mar 21 12:11:57.080491 systemd[1]: Finished systemd-fsck-usr.service. Mar 21 12:11:57.080501 systemd[1]: Starting systemd-tmpfiles-setup-dev-early.service - Create Static Device Nodes in /dev gracefully... Mar 21 12:11:57.080509 systemd[1]: Finished ignition-setup-pre.service - Ignition env setup. Mar 21 12:11:57.080533 systemd-journald[234]: Collecting audit messages is disabled. Mar 21 12:11:57.080555 systemd[1]: Finished systemd-vconsole-setup.service - Virtual Console Setup. Mar 21 12:11:57.080563 kernel: bridge: filtering via arp/ip/ip6tables is no longer available by default. Update your scripts to load br_netfilter if you need this. Mar 21 12:11:57.080570 kernel: Bridge firewalling registered Mar 21 12:11:57.080578 systemd[1]: Finished systemd-tmpfiles-setup-dev-early.service - Create Static Device Nodes in /dev gracefully. Mar 21 12:11:57.080587 systemd-journald[234]: Journal started Mar 21 12:11:57.080607 systemd-journald[234]: Runtime Journal (/run/log/journal/88aa689492c648fca856f90c55b229c7) is 5.9M, max 47.3M, 41.4M free. Mar 21 12:11:57.059712 systemd-modules-load[238]: Inserted module 'overlay' Mar 21 12:11:57.079865 systemd-modules-load[238]: Inserted module 'br_netfilter' Mar 21 12:11:57.086280 systemd[1]: Started systemd-journald.service - Journal Service. Mar 21 12:11:57.086748 systemd[1]: Finished systemd-modules-load.service - Load Kernel Modules. Mar 21 12:11:57.090938 systemd[1]: Starting dracut-cmdline-ask.service - dracut ask for additional cmdline parameters... Mar 21 12:11:57.093893 systemd[1]: Starting systemd-sysctl.service - Apply Kernel Variables... Mar 21 12:11:57.097886 systemd[1]: Starting systemd-tmpfiles-setup-dev.service - Create Static Device Nodes in /dev... Mar 21 12:11:57.107266 systemd[1]: Starting systemd-tmpfiles-setup.service - Create System Files and Directories... Mar 21 12:11:57.115423 systemd[1]: Finished systemd-tmpfiles-setup-dev.service - Create Static Device Nodes in /dev. Mar 21 12:11:57.118460 systemd[1]: Finished systemd-sysctl.service - Apply Kernel Variables. Mar 21 12:11:57.119869 systemd[1]: Finished systemd-tmpfiles-setup.service - Create System Files and Directories. Mar 21 12:11:57.124245 systemd[1]: Starting systemd-resolved.service - Network Name Resolution... Mar 21 12:11:57.126588 systemd[1]: Finished dracut-cmdline-ask.service - dracut ask for additional cmdline parameters. Mar 21 12:11:57.128878 systemd[1]: Starting dracut-cmdline.service - dracut cmdline hook... Mar 21 12:11:57.149415 dracut-cmdline[279]: dracut-dracut-053 Mar 21 12:11:57.153461 dracut-cmdline[279]: Using kernel command line parameters: rd.driver.pre=btrfs BOOT_IMAGE=/flatcar/vmlinuz-a mount.usr=/dev/mapper/usr verity.usr=PARTUUID=7130c94a-213a-4e5a-8e26-6cce9662f132 rootflags=rw mount.usrflags=ro consoleblank=0 root=LABEL=ROOT console=ttyS0,115200 flatcar.first_boot=detected acpi=force verity.usrhash=93cb17f03b776356c0810b716fff0c7c2012572bbe395c702f6873d17674684f Mar 21 12:11:57.178855 systemd-resolved[278]: Positive Trust Anchors: Mar 21 12:11:57.178873 systemd-resolved[278]: . IN DS 20326 8 2 e06d44b80b8f1d39a95c0b0d7c65d08458e880409bbc683457104237c7f8ec8d Mar 21 12:11:57.178905 systemd-resolved[278]: 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 Mar 21 12:11:57.191309 systemd-resolved[278]: Defaulting to hostname 'linux'. Mar 21 12:11:57.192664 systemd[1]: Started systemd-resolved.service - Network Name Resolution. Mar 21 12:11:57.194833 systemd[1]: Reached target nss-lookup.target - Host and Network Name Lookups. Mar 21 12:11:57.246770 kernel: SCSI subsystem initialized Mar 21 12:11:57.250756 kernel: Loading iSCSI transport class v2.0-870. Mar 21 12:11:57.258776 kernel: iscsi: registered transport (tcp) Mar 21 12:11:57.271774 kernel: iscsi: registered transport (qla4xxx) Mar 21 12:11:57.271801 kernel: QLogic iSCSI HBA Driver Mar 21 12:11:57.312341 systemd[1]: Finished dracut-cmdline.service - dracut cmdline hook. Mar 21 12:11:57.314643 systemd[1]: Starting dracut-pre-udev.service - dracut pre-udev hook... Mar 21 12:11:57.346214 kernel: device-mapper: core: CONFIG_IMA_DISABLE_HTABLE is disabled. Duplicate IMA measurements will not be recorded in the IMA log. Mar 21 12:11:57.346265 kernel: device-mapper: uevent: version 1.0.3 Mar 21 12:11:57.349759 kernel: device-mapper: ioctl: 4.48.0-ioctl (2023-03-01) initialised: dm-devel@redhat.com Mar 21 12:11:57.394780 kernel: raid6: neonx8 gen() 15779 MB/s Mar 21 12:11:57.411764 kernel: raid6: neonx4 gen() 15799 MB/s Mar 21 12:11:57.428766 kernel: raid6: neonx2 gen() 13183 MB/s Mar 21 12:11:57.445765 kernel: raid6: neonx1 gen() 10470 MB/s Mar 21 12:11:57.462763 kernel: raid6: int64x8 gen() 6780 MB/s Mar 21 12:11:57.479764 kernel: raid6: int64x4 gen() 7343 MB/s Mar 21 12:11:57.496765 kernel: raid6: int64x2 gen() 6108 MB/s Mar 21 12:11:57.513885 kernel: raid6: int64x1 gen() 5052 MB/s Mar 21 12:11:57.513901 kernel: raid6: using algorithm neonx4 gen() 15799 MB/s Mar 21 12:11:57.531885 kernel: raid6: .... xor() 12454 MB/s, rmw enabled Mar 21 12:11:57.531914 kernel: raid6: using neon recovery algorithm Mar 21 12:11:57.537112 kernel: xor: measuring software checksum speed Mar 21 12:11:57.537129 kernel: 8regs : 21613 MB/sec Mar 21 12:11:57.537761 kernel: 32regs : 21687 MB/sec Mar 21 12:11:57.538997 kernel: arm64_neon : 27860 MB/sec Mar 21 12:11:57.539018 kernel: xor: using function: arm64_neon (27860 MB/sec) Mar 21 12:11:57.593769 kernel: Btrfs loaded, zoned=no, fsverity=no Mar 21 12:11:57.608774 systemd[1]: Finished dracut-pre-udev.service - dracut pre-udev hook. Mar 21 12:11:57.611461 systemd[1]: Starting systemd-udevd.service - Rule-based Manager for Device Events and Files... Mar 21 12:11:57.635106 systemd-udevd[463]: Using default interface naming scheme 'v255'. Mar 21 12:11:57.638864 systemd[1]: Started systemd-udevd.service - Rule-based Manager for Device Events and Files. Mar 21 12:11:57.641797 systemd[1]: Starting dracut-pre-trigger.service - dracut pre-trigger hook... Mar 21 12:11:57.664980 dracut-pre-trigger[471]: rd.md=0: removing MD RAID activation Mar 21 12:11:57.691178 systemd[1]: Finished dracut-pre-trigger.service - dracut pre-trigger hook. Mar 21 12:11:57.693499 systemd[1]: Starting systemd-udev-trigger.service - Coldplug All udev Devices... Mar 21 12:11:57.747000 systemd[1]: Finished systemd-udev-trigger.service - Coldplug All udev Devices. Mar 21 12:11:57.750911 systemd[1]: Starting dracut-initqueue.service - dracut initqueue hook... Mar 21 12:11:57.770676 systemd[1]: Finished dracut-initqueue.service - dracut initqueue hook. Mar 21 12:11:57.772210 systemd[1]: Reached target remote-fs-pre.target - Preparation for Remote File Systems. Mar 21 12:11:57.773924 systemd[1]: Reached target remote-cryptsetup.target - Remote Encrypted Volumes. Mar 21 12:11:57.776325 systemd[1]: Reached target remote-fs.target - Remote File Systems. Mar 21 12:11:57.779292 systemd[1]: Starting dracut-pre-mount.service - dracut pre-mount hook... Mar 21 12:11:57.801402 systemd[1]: Finished dracut-pre-mount.service - dracut pre-mount hook. Mar 21 12:11:57.804882 kernel: virtio_blk virtio1: 1/0/0 default/read/poll queues Mar 21 12:11:57.813496 kernel: virtio_blk virtio1: [vda] 9289728 512-byte logical blocks (4.76 GB/4.43 GiB) Mar 21 12:11:57.813606 kernel: vda: vda1 vda2 vda3 vda4 vda6 vda7 vda9 Mar 21 12:11:57.812687 systemd[1]: dracut-cmdline-ask.service: Deactivated successfully. Mar 21 12:11:57.812835 systemd[1]: Stopped dracut-cmdline-ask.service - dracut ask for additional cmdline parameters. Mar 21 12:11:57.816906 systemd[1]: Stopping dracut-cmdline-ask.service - dracut ask for additional cmdline parameters... Mar 21 12:11:57.819769 systemd[1]: systemd-vconsole-setup.service: Deactivated successfully. Mar 21 12:11:57.819915 systemd[1]: Stopped systemd-vconsole-setup.service - Virtual Console Setup. Mar 21 12:11:57.824632 systemd[1]: Stopping systemd-vconsole-setup.service - Virtual Console Setup... Mar 21 12:11:57.827961 systemd[1]: Starting systemd-vconsole-setup.service - Virtual Console Setup... Mar 21 12:11:57.834789 kernel: BTRFS: device fsid bdcda679-e2cc-43ec-88ed-d0a5c8807e76 devid 1 transid 39 /dev/vda3 scanned by (udev-worker) (518) Mar 21 12:11:57.837444 kernel: BTRFS: device label OEM devid 1 transid 15 /dev/vda6 scanned by (udev-worker) (521) Mar 21 12:11:57.844911 systemd[1]: Found device dev-disk-by\x2dlabel-EFI\x2dSYSTEM.device - /dev/disk/by-label/EFI-SYSTEM. Mar 21 12:11:57.847107 systemd[1]: Finished systemd-vconsole-setup.service - Virtual Console Setup. Mar 21 12:11:57.872174 systemd[1]: Found device dev-disk-by\x2dlabel-ROOT.device - /dev/disk/by-label/ROOT. Mar 21 12:11:57.880794 systemd[1]: Found device dev-disk-by\x2dlabel-OEM.device - /dev/disk/by-label/OEM. Mar 21 12:11:57.887664 systemd[1]: Found device dev-disk-by\x2dpartlabel-USR\x2dA.device - /dev/disk/by-partlabel/USR-A. Mar 21 12:11:57.888901 systemd[1]: Found device dev-disk-by\x2dpartuuid-7130c94a\x2d213a\x2d4e5a\x2d8e26\x2d6cce9662f132.device - /dev/disk/by-partuuid/7130c94a-213a-4e5a-8e26-6cce9662f132. Mar 21 12:11:57.891886 systemd[1]: Starting disk-uuid.service - Generate new UUID for disk GPT if necessary... Mar 21 12:11:57.894990 systemd[1]: Starting dracut-cmdline-ask.service - dracut ask for additional cmdline parameters... Mar 21 12:11:57.912775 kernel: vda: vda1 vda2 vda3 vda4 vda6 vda7 vda9 Mar 21 12:11:57.921207 systemd[1]: Finished dracut-cmdline-ask.service - dracut ask for additional cmdline parameters. Mar 21 12:11:58.926763 kernel: vda: vda1 vda2 vda3 vda4 vda6 vda7 vda9 Mar 21 12:11:58.927116 disk-uuid[553]: The operation has completed successfully. Mar 21 12:11:58.957228 systemd[1]: disk-uuid.service: Deactivated successfully. Mar 21 12:11:58.957334 systemd[1]: Finished disk-uuid.service - Generate new UUID for disk GPT if necessary. Mar 21 12:11:58.985430 systemd[1]: Starting verity-setup.service - Verity Setup for /dev/mapper/usr... Mar 21 12:11:59.000859 sh[573]: Success Mar 21 12:11:59.017762 kernel: device-mapper: verity: sha256 using implementation "sha256-ce" Mar 21 12:11:59.048633 systemd[1]: Found device dev-mapper-usr.device - /dev/mapper/usr. Mar 21 12:11:59.051553 systemd[1]: Mounting sysusr-usr.mount - /sysusr/usr... Mar 21 12:11:59.073983 systemd[1]: Finished verity-setup.service - Verity Setup for /dev/mapper/usr. Mar 21 12:11:59.082176 kernel: BTRFS info (device dm-0): first mount of filesystem bdcda679-e2cc-43ec-88ed-d0a5c8807e76 Mar 21 12:11:59.082205 kernel: BTRFS info (device dm-0): using crc32c (crc32c-generic) checksum algorithm Mar 21 12:11:59.082216 kernel: BTRFS warning (device dm-0): 'nologreplay' is deprecated, use 'rescue=nologreplay' instead Mar 21 12:11:59.084261 kernel: BTRFS info (device dm-0): disabling log replay at mount time Mar 21 12:11:59.084976 kernel: BTRFS info (device dm-0): using free space tree Mar 21 12:11:59.089086 systemd[1]: Mounted sysusr-usr.mount - /sysusr/usr. Mar 21 12:11:59.090557 systemd[1]: afterburn-network-kargs.service - Afterburn Initrd Setup Network Kernel Arguments was skipped because no trigger condition checks were met. Mar 21 12:11:59.091380 systemd[1]: Starting ignition-setup.service - Ignition (setup)... Mar 21 12:11:59.094523 systemd[1]: Starting parse-ip-for-networkd.service - Write systemd-networkd units from cmdline... Mar 21 12:11:59.114001 kernel: BTRFS info (device vda6): first mount of filesystem fea78075-4b56-496a-88c9-8f4cfa7493bf Mar 21 12:11:59.114059 kernel: BTRFS info (device vda6): using crc32c (crc32c-generic) checksum algorithm Mar 21 12:11:59.114851 kernel: BTRFS info (device vda6): using free space tree Mar 21 12:11:59.118389 kernel: BTRFS info (device vda6): auto enabling async discard Mar 21 12:11:59.121884 kernel: BTRFS info (device vda6): last unmount of filesystem fea78075-4b56-496a-88c9-8f4cfa7493bf Mar 21 12:11:59.125826 systemd[1]: Finished ignition-setup.service - Ignition (setup). Mar 21 12:11:59.128585 systemd[1]: Starting ignition-fetch-offline.service - Ignition (fetch-offline)... Mar 21 12:11:59.211478 systemd[1]: Finished parse-ip-for-networkd.service - Write systemd-networkd units from cmdline. Mar 21 12:11:59.215479 systemd[1]: Starting systemd-networkd.service - Network Configuration... Mar 21 12:11:59.291584 systemd-networkd[757]: lo: Link UP Mar 21 12:11:59.292437 systemd-networkd[757]: lo: Gained carrier Mar 21 12:11:59.293379 systemd-networkd[757]: Enumeration completed Mar 21 12:11:59.293490 systemd[1]: Started systemd-networkd.service - Network Configuration. Mar 21 12:11:59.294534 systemd-networkd[757]: eth0: found matching network '/usr/lib/systemd/network/zz-default.network', based on potentially unpredictable interface name. Mar 21 12:11:59.294538 systemd-networkd[757]: eth0: Configuring with /usr/lib/systemd/network/zz-default.network. Mar 21 12:11:59.294708 systemd[1]: Reached target network.target - Network. Mar 21 12:11:59.296764 systemd-networkd[757]: eth0: Link UP Mar 21 12:11:59.296768 systemd-networkd[757]: eth0: Gained carrier Mar 21 12:11:59.296775 systemd-networkd[757]: eth0: found matching network '/usr/lib/systemd/network/zz-default.network', based on potentially unpredictable interface name. Mar 21 12:11:59.306506 ignition[665]: Ignition 2.20.0 Mar 21 12:11:59.306517 ignition[665]: Stage: fetch-offline Mar 21 12:11:59.306551 ignition[665]: no configs at "/usr/lib/ignition/base.d" Mar 21 12:11:59.306559 ignition[665]: no config dir at "/usr/lib/ignition/base.platform.d/qemu" Mar 21 12:11:59.306723 ignition[665]: parsed url from cmdline: "" Mar 21 12:11:59.306727 ignition[665]: no config URL provided Mar 21 12:11:59.306731 ignition[665]: reading system config file "/usr/lib/ignition/user.ign" Mar 21 12:11:59.306753 ignition[665]: no config at "/usr/lib/ignition/user.ign" Mar 21 12:11:59.306778 ignition[665]: op(1): [started] loading QEMU firmware config module Mar 21 12:11:59.306783 ignition[665]: op(1): executing: "modprobe" "qemu_fw_cfg" Mar 21 12:11:59.316996 ignition[665]: op(1): [finished] loading QEMU firmware config module Mar 21 12:11:59.320174 ignition[665]: parsing config with SHA512: 6cc177294468d6aea1ce2d8b40b969ce59732b62a92c7f05773d41598cd5e1fd3d5a021a20286fb1ee0c9a09f6637a841a578b0820475055d0f25a1baaf37675 Mar 21 12:11:59.322083 systemd-networkd[757]: eth0: DHCPv4 address 10.0.0.4/16, gateway 10.0.0.1 acquired from 10.0.0.1 Mar 21 12:11:59.325498 unknown[665]: fetched base config from "system" Mar 21 12:11:59.325509 unknown[665]: fetched user config from "qemu" Mar 21 12:11:59.326836 ignition[665]: fetch-offline: fetch-offline passed Mar 21 12:11:59.326962 ignition[665]: Ignition finished successfully Mar 21 12:11:59.328781 systemd[1]: Finished ignition-fetch-offline.service - Ignition (fetch-offline). Mar 21 12:11:59.330845 systemd[1]: ignition-fetch.service - Ignition (fetch) was skipped because of an unmet condition check (ConditionPathExists=!/run/ignition.json). Mar 21 12:11:59.331586 systemd[1]: Starting ignition-kargs.service - Ignition (kargs)... Mar 21 12:11:59.359077 ignition[773]: Ignition 2.20.0 Mar 21 12:11:59.359087 ignition[773]: Stage: kargs Mar 21 12:11:59.359248 ignition[773]: no configs at "/usr/lib/ignition/base.d" Mar 21 12:11:59.359258 ignition[773]: no config dir at "/usr/lib/ignition/base.platform.d/qemu" Mar 21 12:11:59.361929 systemd[1]: Finished ignition-kargs.service - Ignition (kargs). Mar 21 12:11:59.359873 ignition[773]: kargs: kargs passed Mar 21 12:11:59.359915 ignition[773]: Ignition finished successfully Mar 21 12:11:59.366474 systemd[1]: Starting ignition-disks.service - Ignition (disks)... Mar 21 12:11:59.393898 ignition[782]: Ignition 2.20.0 Mar 21 12:11:59.393908 ignition[782]: Stage: disks Mar 21 12:11:59.394059 ignition[782]: no configs at "/usr/lib/ignition/base.d" Mar 21 12:11:59.394069 ignition[782]: no config dir at "/usr/lib/ignition/base.platform.d/qemu" Mar 21 12:11:59.396795 systemd[1]: Finished ignition-disks.service - Ignition (disks). Mar 21 12:11:59.394630 ignition[782]: disks: disks passed Mar 21 12:11:59.398451 systemd[1]: Reached target initrd-root-device.target - Initrd Root Device. Mar 21 12:11:59.394671 ignition[782]: Ignition finished successfully Mar 21 12:11:59.400133 systemd[1]: Reached target local-fs-pre.target - Preparation for Local File Systems. Mar 21 12:11:59.401813 systemd[1]: Reached target local-fs.target - Local File Systems. Mar 21 12:11:59.403821 systemd[1]: Reached target sysinit.target - System Initialization. Mar 21 12:11:59.405480 systemd[1]: Reached target basic.target - Basic System. Mar 21 12:11:59.407672 systemd-resolved[278]: Detected conflict on linux IN A 10.0.0.4 Mar 21 12:11:59.407681 systemd-resolved[278]: Hostname conflict, changing published hostname from 'linux' to 'linux5'. Mar 21 12:11:59.408653 systemd[1]: Starting systemd-fsck-root.service - File System Check on /dev/disk/by-label/ROOT... Mar 21 12:11:59.441670 systemd-fsck[793]: ROOT: clean, 14/553520 files, 52654/553472 blocks Mar 21 12:11:59.445785 systemd[1]: Finished systemd-fsck-root.service - File System Check on /dev/disk/by-label/ROOT. Mar 21 12:11:59.448330 systemd[1]: Mounting sysroot.mount - /sysroot... Mar 21 12:11:59.501760 kernel: EXT4-fs (vda9): mounted filesystem 3004295c-1fab-4723-a953-2dc6fc131037 r/w with ordered data mode. Quota mode: none. Mar 21 12:11:59.502251 systemd[1]: Mounted sysroot.mount - /sysroot. Mar 21 12:11:59.503582 systemd[1]: Reached target initrd-root-fs.target - Initrd Root File System. Mar 21 12:11:59.505910 systemd[1]: Mounting sysroot-oem.mount - /sysroot/oem... Mar 21 12:11:59.507524 systemd[1]: Mounting sysroot-usr.mount - /sysroot/usr... Mar 21 12:11:59.508557 systemd[1]: flatcar-metadata-hostname.service - Flatcar Metadata Hostname Agent was skipped because no trigger condition checks were met. Mar 21 12:11:59.508597 systemd[1]: ignition-remount-sysroot.service - Remount /sysroot read-write for Ignition was skipped because of an unmet condition check (ConditionPathIsReadWrite=!/sysroot). Mar 21 12:11:59.508621 systemd[1]: Reached target ignition-diskful.target - Ignition Boot Disk Setup. Mar 21 12:11:59.526324 systemd[1]: Mounted sysroot-usr.mount - /sysroot/usr. Mar 21 12:11:59.528991 systemd[1]: Starting initrd-setup-root.service - Root filesystem setup... Mar 21 12:11:59.533162 kernel: BTRFS: device label OEM devid 1 transid 16 /dev/vda6 scanned by mount (801) Mar 21 12:11:59.533184 kernel: BTRFS info (device vda6): first mount of filesystem fea78075-4b56-496a-88c9-8f4cfa7493bf Mar 21 12:11:59.533194 kernel: BTRFS info (device vda6): using crc32c (crc32c-generic) checksum algorithm Mar 21 12:11:59.533204 kernel: BTRFS info (device vda6): using free space tree Mar 21 12:11:59.538752 kernel: BTRFS info (device vda6): auto enabling async discard Mar 21 12:11:59.539827 systemd[1]: Mounted sysroot-oem.mount - /sysroot/oem. Mar 21 12:11:59.584192 initrd-setup-root[825]: cut: /sysroot/etc/passwd: No such file or directory Mar 21 12:11:59.587260 initrd-setup-root[832]: cut: /sysroot/etc/group: No such file or directory Mar 21 12:11:59.590345 initrd-setup-root[839]: cut: /sysroot/etc/shadow: No such file or directory Mar 21 12:11:59.593435 initrd-setup-root[846]: cut: /sysroot/etc/gshadow: No such file or directory Mar 21 12:11:59.692240 systemd[1]: Finished initrd-setup-root.service - Root filesystem setup. Mar 21 12:11:59.694254 systemd[1]: Starting ignition-mount.service - Ignition (mount)... Mar 21 12:11:59.695863 systemd[1]: Starting sysroot-boot.service - /sysroot/boot... Mar 21 12:11:59.714777 kernel: BTRFS info (device vda6): last unmount of filesystem fea78075-4b56-496a-88c9-8f4cfa7493bf Mar 21 12:11:59.728911 systemd[1]: Finished sysroot-boot.service - /sysroot/boot. Mar 21 12:11:59.731497 ignition[914]: INFO : Ignition 2.20.0 Mar 21 12:11:59.731497 ignition[914]: INFO : Stage: mount Mar 21 12:11:59.733142 ignition[914]: INFO : no configs at "/usr/lib/ignition/base.d" Mar 21 12:11:59.733142 ignition[914]: INFO : no config dir at "/usr/lib/ignition/base.platform.d/qemu" Mar 21 12:11:59.733142 ignition[914]: INFO : mount: mount passed Mar 21 12:11:59.733142 ignition[914]: INFO : Ignition finished successfully Mar 21 12:11:59.733526 systemd[1]: Finished ignition-mount.service - Ignition (mount). Mar 21 12:11:59.735919 systemd[1]: Starting ignition-files.service - Ignition (files)... Mar 21 12:12:00.081088 systemd[1]: sysroot-oem.mount: Deactivated successfully. Mar 21 12:12:00.082707 systemd[1]: Mounting sysroot-oem.mount - /sysroot/oem... Mar 21 12:12:00.099755 kernel: BTRFS: device label OEM devid 1 transid 17 /dev/vda6 scanned by mount (927) Mar 21 12:12:00.102039 kernel: BTRFS info (device vda6): first mount of filesystem fea78075-4b56-496a-88c9-8f4cfa7493bf Mar 21 12:12:00.102069 kernel: BTRFS info (device vda6): using crc32c (crc32c-generic) checksum algorithm Mar 21 12:12:00.102079 kernel: BTRFS info (device vda6): using free space tree Mar 21 12:12:00.104757 kernel: BTRFS info (device vda6): auto enabling async discard Mar 21 12:12:00.106204 systemd[1]: Mounted sysroot-oem.mount - /sysroot/oem. Mar 21 12:12:00.135617 ignition[944]: INFO : Ignition 2.20.0 Mar 21 12:12:00.135617 ignition[944]: INFO : Stage: files Mar 21 12:12:00.137448 ignition[944]: INFO : no configs at "/usr/lib/ignition/base.d" Mar 21 12:12:00.137448 ignition[944]: INFO : no config dir at "/usr/lib/ignition/base.platform.d/qemu" Mar 21 12:12:00.137448 ignition[944]: DEBUG : files: compiled without relabeling support, skipping Mar 21 12:12:00.137448 ignition[944]: INFO : files: ensureUsers: op(1): [started] creating or modifying user "core" Mar 21 12:12:00.137448 ignition[944]: DEBUG : files: ensureUsers: op(1): executing: "usermod" "--root" "/sysroot" "core" Mar 21 12:12:00.144956 ignition[944]: INFO : files: ensureUsers: op(1): [finished] creating or modifying user "core" Mar 21 12:12:00.144956 ignition[944]: INFO : files: ensureUsers: op(2): [started] adding ssh keys to user "core" Mar 21 12:12:00.144956 ignition[944]: INFO : files: ensureUsers: op(2): [finished] adding ssh keys to user "core" Mar 21 12:12:00.144956 ignition[944]: INFO : files: createFilesystemsFiles: createFiles: op(3): [started] writing file "/sysroot/etc/flatcar/update.conf" Mar 21 12:12:00.144956 ignition[944]: INFO : files: createFilesystemsFiles: createFiles: op(3): [finished] writing file "/sysroot/etc/flatcar/update.conf" Mar 21 12:12:00.144956 ignition[944]: INFO : files: op(4): [started] processing unit "coreos-metadata.service" Mar 21 12:12:00.144956 ignition[944]: INFO : files: op(4): op(5): [started] writing unit "coreos-metadata.service" at "/sysroot/etc/systemd/system/coreos-metadata.service" Mar 21 12:12:00.144956 ignition[944]: INFO : files: op(4): op(5): [finished] writing unit "coreos-metadata.service" at "/sysroot/etc/systemd/system/coreos-metadata.service" Mar 21 12:12:00.144956 ignition[944]: INFO : files: op(4): [finished] processing unit "coreos-metadata.service" Mar 21 12:12:00.144956 ignition[944]: INFO : files: createResultFile: createFiles: op(6): [started] writing file "/sysroot/etc/.ignition-result.json" Mar 21 12:12:00.144956 ignition[944]: INFO : files: createResultFile: createFiles: op(6): [finished] writing file "/sysroot/etc/.ignition-result.json" Mar 21 12:12:00.144956 ignition[944]: INFO : files: files passed Mar 21 12:12:00.144956 ignition[944]: INFO : Ignition finished successfully Mar 21 12:12:00.140146 unknown[944]: wrote ssh authorized keys file for user: core Mar 21 12:12:00.144014 systemd[1]: Finished ignition-files.service - Ignition (files). Mar 21 12:12:00.146880 systemd[1]: Starting ignition-quench.service - Ignition (record completion)... Mar 21 12:12:00.148941 systemd[1]: Starting initrd-setup-root-after-ignition.service - Root filesystem completion... Mar 21 12:12:00.172946 initrd-setup-root-after-ignition[970]: grep: /sysroot/oem/oem-release: No such file or directory Mar 21 12:12:00.165699 systemd[1]: ignition-quench.service: Deactivated successfully. Mar 21 12:12:00.177320 initrd-setup-root-after-ignition[972]: grep: /sysroot/etc/flatcar/enabled-sysext.conf: No such file or directory Mar 21 12:12:00.177320 initrd-setup-root-after-ignition[972]: grep: /sysroot/usr/share/flatcar/enabled-sysext.conf: No such file or directory Mar 21 12:12:00.165819 systemd[1]: Finished ignition-quench.service - Ignition (record completion). Mar 21 12:12:00.182567 initrd-setup-root-after-ignition[976]: grep: /sysroot/etc/flatcar/enabled-sysext.conf: No such file or directory Mar 21 12:12:00.172541 systemd[1]: Finished initrd-setup-root-after-ignition.service - Root filesystem completion. Mar 21 12:12:00.174550 systemd[1]: Reached target ignition-complete.target - Ignition Complete. Mar 21 12:12:00.177247 systemd[1]: Starting initrd-parse-etc.service - Mountpoints Configured in the Real Root... Mar 21 12:12:00.218142 systemd[1]: initrd-parse-etc.service: Deactivated successfully. Mar 21 12:12:00.218252 systemd[1]: Finished initrd-parse-etc.service - Mountpoints Configured in the Real Root. Mar 21 12:12:00.220633 systemd[1]: Reached target initrd-fs.target - Initrd File Systems. Mar 21 12:12:00.222568 systemd[1]: Reached target initrd.target - Initrd Default Target. Mar 21 12:12:00.224389 systemd[1]: dracut-mount.service - dracut mount hook was skipped because no trigger condition checks were met. Mar 21 12:12:00.225206 systemd[1]: Starting dracut-pre-pivot.service - dracut pre-pivot and cleanup hook... Mar 21 12:12:00.245883 systemd[1]: Finished dracut-pre-pivot.service - dracut pre-pivot and cleanup hook. Mar 21 12:12:00.248599 systemd[1]: Starting initrd-cleanup.service - Cleaning Up and Shutting Down Daemons... Mar 21 12:12:00.271007 systemd[1]: Stopped target nss-lookup.target - Host and Network Name Lookups. Mar 21 12:12:00.272296 systemd[1]: Stopped target remote-cryptsetup.target - Remote Encrypted Volumes. Mar 21 12:12:00.274521 systemd[1]: Stopped target timers.target - Timer Units. Mar 21 12:12:00.276475 systemd[1]: dracut-pre-pivot.service: Deactivated successfully. Mar 21 12:12:00.276617 systemd[1]: Stopped dracut-pre-pivot.service - dracut pre-pivot and cleanup hook. Mar 21 12:12:00.279387 systemd[1]: Stopped target initrd.target - Initrd Default Target. Mar 21 12:12:00.281558 systemd[1]: Stopped target basic.target - Basic System. Mar 21 12:12:00.283298 systemd[1]: Stopped target ignition-complete.target - Ignition Complete. Mar 21 12:12:00.285205 systemd[1]: Stopped target ignition-diskful.target - Ignition Boot Disk Setup. Mar 21 12:12:00.287272 systemd[1]: Stopped target initrd-root-device.target - Initrd Root Device. Mar 21 12:12:00.289340 systemd[1]: Stopped target remote-fs.target - Remote File Systems. Mar 21 12:12:00.291369 systemd[1]: Stopped target remote-fs-pre.target - Preparation for Remote File Systems. Mar 21 12:12:00.293473 systemd[1]: Stopped target sysinit.target - System Initialization. Mar 21 12:12:00.295560 systemd[1]: Stopped target local-fs.target - Local File Systems. Mar 21 12:12:00.297419 systemd[1]: Stopped target swap.target - Swaps. Mar 21 12:12:00.299024 systemd[1]: dracut-pre-mount.service: Deactivated successfully. Mar 21 12:12:00.299158 systemd[1]: Stopped dracut-pre-mount.service - dracut pre-mount hook. Mar 21 12:12:00.301633 systemd[1]: Stopped target cryptsetup.target - Local Encrypted Volumes. Mar 21 12:12:00.302865 systemd[1]: Stopped target cryptsetup-pre.target - Local Encrypted Volumes (Pre). Mar 21 12:12:00.304803 systemd[1]: clevis-luks-askpass.path: Deactivated successfully. Mar 21 12:12:00.305830 systemd[1]: Stopped clevis-luks-askpass.path - Forward Password Requests to Clevis Directory Watch. Mar 21 12:12:00.308165 systemd[1]: dracut-initqueue.service: Deactivated successfully. Mar 21 12:12:00.308294 systemd[1]: Stopped dracut-initqueue.service - dracut initqueue hook. Mar 21 12:12:00.311261 systemd[1]: ignition-fetch-offline.service: Deactivated successfully. Mar 21 12:12:00.311396 systemd[1]: Stopped ignition-fetch-offline.service - Ignition (fetch-offline). Mar 21 12:12:00.313462 systemd[1]: Stopped target paths.target - Path Units. Mar 21 12:12:00.315121 systemd[1]: systemd-ask-password-console.path: Deactivated successfully. Mar 21 12:12:00.318802 systemd[1]: Stopped systemd-ask-password-console.path - Dispatch Password Requests to Console Directory Watch. Mar 21 12:12:00.320383 systemd[1]: Stopped target slices.target - Slice Units. Mar 21 12:12:00.322645 systemd[1]: Stopped target sockets.target - Socket Units. Mar 21 12:12:00.324346 systemd[1]: iscsid.socket: Deactivated successfully. Mar 21 12:12:00.324430 systemd[1]: Closed iscsid.socket - Open-iSCSI iscsid Socket. Mar 21 12:12:00.326116 systemd[1]: iscsiuio.socket: Deactivated successfully. Mar 21 12:12:00.326199 systemd[1]: Closed iscsiuio.socket - Open-iSCSI iscsiuio Socket. Mar 21 12:12:00.327823 systemd[1]: initrd-setup-root-after-ignition.service: Deactivated successfully. Mar 21 12:12:00.327943 systemd[1]: Stopped initrd-setup-root-after-ignition.service - Root filesystem completion. Mar 21 12:12:00.329894 systemd[1]: ignition-files.service: Deactivated successfully. Mar 21 12:12:00.329998 systemd[1]: Stopped ignition-files.service - Ignition (files). Mar 21 12:12:00.332548 systemd[1]: Stopping ignition-mount.service - Ignition (mount)... Mar 21 12:12:00.335269 systemd[1]: Stopping sysroot-boot.service - /sysroot/boot... Mar 21 12:12:00.336568 systemd[1]: systemd-udev-trigger.service: Deactivated successfully. Mar 21 12:12:00.336684 systemd[1]: Stopped systemd-udev-trigger.service - Coldplug All udev Devices. Mar 21 12:12:00.338976 systemd[1]: dracut-pre-trigger.service: Deactivated successfully. Mar 21 12:12:00.339084 systemd[1]: Stopped dracut-pre-trigger.service - dracut pre-trigger hook. Mar 21 12:12:00.348957 systemd[1]: initrd-cleanup.service: Deactivated successfully. Mar 21 12:12:00.349057 systemd[1]: Finished initrd-cleanup.service - Cleaning Up and Shutting Down Daemons. Mar 21 12:12:00.358639 systemd[1]: sysroot-boot.mount: Deactivated successfully. Mar 21 12:12:00.360130 ignition[997]: INFO : Ignition 2.20.0 Mar 21 12:12:00.360130 ignition[997]: INFO : Stage: umount Mar 21 12:12:00.361826 ignition[997]: INFO : no configs at "/usr/lib/ignition/base.d" Mar 21 12:12:00.361826 ignition[997]: INFO : no config dir at "/usr/lib/ignition/base.platform.d/qemu" Mar 21 12:12:00.361826 ignition[997]: INFO : umount: umount passed Mar 21 12:12:00.364818 ignition[997]: INFO : Ignition finished successfully Mar 21 12:12:00.363170 systemd[1]: sysroot-boot.service: Deactivated successfully. Mar 21 12:12:00.364774 systemd[1]: Stopped sysroot-boot.service - /sysroot/boot. Mar 21 12:12:00.365989 systemd[1]: ignition-mount.service: Deactivated successfully. Mar 21 12:12:00.366067 systemd[1]: Stopped ignition-mount.service - Ignition (mount). Mar 21 12:12:00.368218 systemd[1]: Stopped target network.target - Network. Mar 21 12:12:00.369541 systemd[1]: ignition-disks.service: Deactivated successfully. Mar 21 12:12:00.369620 systemd[1]: Stopped ignition-disks.service - Ignition (disks). Mar 21 12:12:00.371475 systemd[1]: ignition-kargs.service: Deactivated successfully. Mar 21 12:12:00.371534 systemd[1]: Stopped ignition-kargs.service - Ignition (kargs). Mar 21 12:12:00.373378 systemd[1]: ignition-setup.service: Deactivated successfully. Mar 21 12:12:00.373424 systemd[1]: Stopped ignition-setup.service - Ignition (setup). Mar 21 12:12:00.375179 systemd[1]: ignition-setup-pre.service: Deactivated successfully. Mar 21 12:12:00.375221 systemd[1]: Stopped ignition-setup-pre.service - Ignition env setup. Mar 21 12:12:00.376936 systemd[1]: initrd-setup-root.service: Deactivated successfully. Mar 21 12:12:00.376986 systemd[1]: Stopped initrd-setup-root.service - Root filesystem setup. Mar 21 12:12:00.378942 systemd[1]: Stopping systemd-networkd.service - Network Configuration... Mar 21 12:12:00.380866 systemd[1]: Stopping systemd-resolved.service - Network Name Resolution... Mar 21 12:12:00.384247 systemd[1]: systemd-resolved.service: Deactivated successfully. Mar 21 12:12:00.384351 systemd[1]: Stopped systemd-resolved.service - Network Name Resolution. Mar 21 12:12:00.387904 systemd[1]: run-credentials-systemd\x2dresolved.service.mount: Deactivated successfully. Mar 21 12:12:00.388206 systemd[1]: systemd-tmpfiles-setup.service: Deactivated successfully. Mar 21 12:12:00.388253 systemd[1]: Stopped systemd-tmpfiles-setup.service - Create System Files and Directories. Mar 21 12:12:00.391578 systemd[1]: run-credentials-systemd\x2dtmpfiles\x2dsetup.service.mount: Deactivated successfully. Mar 21 12:12:00.392688 systemd[1]: systemd-networkd.service: Deactivated successfully. Mar 21 12:12:00.392931 systemd[1]: Stopped systemd-networkd.service - Network Configuration. Mar 21 12:12:00.397123 systemd[1]: systemd-networkd.socket: Deactivated successfully. Mar 21 12:12:00.397156 systemd[1]: Closed systemd-networkd.socket - Network Service Netlink Socket. Mar 21 12:12:00.399186 systemd[1]: Stopping network-cleanup.service - Network Cleanup... Mar 21 12:12:00.400419 systemd[1]: parse-ip-for-networkd.service: Deactivated successfully. Mar 21 12:12:00.400477 systemd[1]: Stopped parse-ip-for-networkd.service - Write systemd-networkd units from cmdline. Mar 21 12:12:00.402637 systemd[1]: systemd-sysctl.service: Deactivated successfully. Mar 21 12:12:00.402698 systemd[1]: Stopped systemd-sysctl.service - Apply Kernel Variables. Mar 21 12:12:00.406114 systemd[1]: systemd-modules-load.service: Deactivated successfully. Mar 21 12:12:00.406156 systemd[1]: Stopped systemd-modules-load.service - Load Kernel Modules. Mar 21 12:12:00.408397 systemd[1]: Stopping systemd-udevd.service - Rule-based Manager for Device Events and Files... Mar 21 12:12:00.420782 systemd[1]: network-cleanup.service: Deactivated successfully. Mar 21 12:12:00.420886 systemd[1]: Stopped network-cleanup.service - Network Cleanup. Mar 21 12:12:00.429443 systemd[1]: systemd-udevd.service: Deactivated successfully. Mar 21 12:12:00.429599 systemd[1]: Stopped systemd-udevd.service - Rule-based Manager for Device Events and Files. Mar 21 12:12:00.431996 systemd[1]: systemd-udevd-control.socket: Deactivated successfully. Mar 21 12:12:00.432037 systemd[1]: Closed systemd-udevd-control.socket - udev Control Socket. Mar 21 12:12:00.433910 systemd[1]: systemd-udevd-kernel.socket: Deactivated successfully. Mar 21 12:12:00.433942 systemd[1]: Closed systemd-udevd-kernel.socket - udev Kernel Socket. Mar 21 12:12:00.435805 systemd[1]: dracut-pre-udev.service: Deactivated successfully. Mar 21 12:12:00.435861 systemd[1]: Stopped dracut-pre-udev.service - dracut pre-udev hook. Mar 21 12:12:00.438664 systemd[1]: dracut-cmdline.service: Deactivated successfully. Mar 21 12:12:00.438710 systemd[1]: Stopped dracut-cmdline.service - dracut cmdline hook. Mar 21 12:12:00.440655 systemd[1]: dracut-cmdline-ask.service: Deactivated successfully. Mar 21 12:12:00.440711 systemd[1]: Stopped dracut-cmdline-ask.service - dracut ask for additional cmdline parameters. Mar 21 12:12:00.444447 systemd[1]: Starting initrd-udevadm-cleanup-db.service - Cleanup udev Database... Mar 21 12:12:00.445700 systemd[1]: systemd-tmpfiles-setup-dev.service: Deactivated successfully. Mar 21 12:12:00.445776 systemd[1]: Stopped systemd-tmpfiles-setup-dev.service - Create Static Device Nodes in /dev. Mar 21 12:12:00.448776 systemd[1]: systemd-tmpfiles-setup-dev-early.service: Deactivated successfully. Mar 21 12:12:00.448821 systemd[1]: Stopped systemd-tmpfiles-setup-dev-early.service - Create Static Device Nodes in /dev gracefully. Mar 21 12:12:00.451249 systemd[1]: kmod-static-nodes.service: Deactivated successfully. Mar 21 12:12:00.451294 systemd[1]: Stopped kmod-static-nodes.service - Create List of Static Device Nodes. Mar 21 12:12:00.453500 systemd[1]: systemd-vconsole-setup.service: Deactivated successfully. Mar 21 12:12:00.453550 systemd[1]: Stopped systemd-vconsole-setup.service - Virtual Console Setup. Mar 21 12:12:00.462933 systemd[1]: initrd-udevadm-cleanup-db.service: Deactivated successfully. Mar 21 12:12:00.463040 systemd[1]: Finished initrd-udevadm-cleanup-db.service - Cleanup udev Database. Mar 21 12:12:00.465487 systemd[1]: Reached target initrd-switch-root.target - Switch Root. Mar 21 12:12:00.468153 systemd[1]: Starting initrd-switch-root.service - Switch Root... Mar 21 12:12:00.483953 systemd[1]: Switching root. Mar 21 12:12:00.519492 systemd-journald[234]: Journal stopped Mar 21 12:12:01.285663 systemd-journald[234]: Received SIGTERM from PID 1 (systemd). Mar 21 12:12:01.285726 kernel: SELinux: policy capability network_peer_controls=1 Mar 21 12:12:01.285748 kernel: SELinux: policy capability open_perms=1 Mar 21 12:12:01.285759 kernel: SELinux: policy capability extended_socket_class=1 Mar 21 12:12:01.285769 kernel: SELinux: policy capability always_check_network=0 Mar 21 12:12:01.285778 kernel: SELinux: policy capability cgroup_seclabel=1 Mar 21 12:12:01.285793 kernel: SELinux: policy capability nnp_nosuid_transition=1 Mar 21 12:12:01.285802 kernel: SELinux: policy capability genfs_seclabel_symlinks=0 Mar 21 12:12:01.285812 kernel: SELinux: policy capability ioctl_skip_cloexec=0 Mar 21 12:12:01.285821 kernel: audit: type=1403 audit(1742559120.595:2): auid=4294967295 ses=4294967295 lsm=selinux res=1 Mar 21 12:12:01.285835 systemd[1]: Successfully loaded SELinux policy in 40.216ms. Mar 21 12:12:01.285851 systemd[1]: Relabeled /dev/, /dev/shm/, /run/ in 9.988ms. Mar 21 12:12:01.285862 systemd[1]: systemd 256.8 running in system mode (+PAM +AUDIT +SELINUX -APPARMOR +IMA +SMACK +SECCOMP +GCRYPT -GNUTLS +OPENSSL -ACL +BLKID +CURL +ELFUTILS -FIDO2 +IDN2 -IDN +IPTC +KMOD +LIBCRYPTSETUP +LIBCRYPTSETUP_PLUGINS +LIBFDISK +PCRE2 -PWQUALITY -P11KIT -QRENCODE +TPM2 +BZIP2 +LZ4 +XZ +ZLIB +ZSTD -BPF_FRAMEWORK -XKBCOMMON +UTMP -SYSVINIT +LIBARCHIVE) Mar 21 12:12:01.285873 systemd[1]: Detected virtualization kvm. Mar 21 12:12:01.285884 systemd[1]: Detected architecture arm64. Mar 21 12:12:01.285894 systemd[1]: Detected first boot. Mar 21 12:12:01.285907 systemd[1]: Initializing machine ID from VM UUID. Mar 21 12:12:01.285918 zram_generator::config[1044]: No configuration found. Mar 21 12:12:01.285934 kernel: NET: Registered PF_VSOCK protocol family Mar 21 12:12:01.285944 systemd[1]: Populated /etc with preset unit settings. Mar 21 12:12:01.285954 systemd[1]: run-credentials-systemd\x2djournald.service.mount: Deactivated successfully. Mar 21 12:12:01.285965 systemd[1]: initrd-switch-root.service: Deactivated successfully. Mar 21 12:12:01.285975 systemd[1]: Stopped initrd-switch-root.service - Switch Root. Mar 21 12:12:01.285986 systemd[1]: systemd-journald.service: Scheduled restart job, restart counter is at 1. Mar 21 12:12:01.285996 systemd[1]: Created slice system-addon\x2dconfig.slice - Slice /system/addon-config. Mar 21 12:12:01.286006 systemd[1]: Created slice system-addon\x2drun.slice - Slice /system/addon-run. Mar 21 12:12:01.286017 systemd[1]: Created slice system-getty.slice - Slice /system/getty. Mar 21 12:12:01.286032 systemd[1]: Created slice system-modprobe.slice - Slice /system/modprobe. Mar 21 12:12:01.286042 systemd[1]: Created slice system-serial\x2dgetty.slice - Slice /system/serial-getty. Mar 21 12:12:01.286053 systemd[1]: Created slice system-system\x2dcloudinit.slice - Slice /system/system-cloudinit. Mar 21 12:12:01.286063 systemd[1]: Created slice system-systemd\x2dfsck.slice - Slice /system/systemd-fsck. Mar 21 12:12:01.286073 systemd[1]: Created slice user.slice - User and Session Slice. Mar 21 12:12:01.286084 systemd[1]: Started clevis-luks-askpass.path - Forward Password Requests to Clevis Directory Watch. Mar 21 12:12:01.286096 systemd[1]: Started systemd-ask-password-console.path - Dispatch Password Requests to Console Directory Watch. Mar 21 12:12:01.286107 systemd[1]: Started systemd-ask-password-wall.path - Forward Password Requests to Wall Directory Watch. Mar 21 12:12:01.286117 systemd[1]: Set up automount boot.automount - Boot partition Automount Point. Mar 21 12:12:01.286128 systemd[1]: Set up automount proc-sys-fs-binfmt_misc.automount - Arbitrary Executable File Formats File System Automount Point. Mar 21 12:12:01.286139 systemd[1]: Expecting device dev-disk-by\x2dlabel-OEM.device - /dev/disk/by-label/OEM... Mar 21 12:12:01.286150 systemd[1]: Expecting device dev-ttyAMA0.device - /dev/ttyAMA0... Mar 21 12:12:01.286160 systemd[1]: Reached target cryptsetup-pre.target - Local Encrypted Volumes (Pre). Mar 21 12:12:01.286170 systemd[1]: Stopped target initrd-switch-root.target - Switch Root. Mar 21 12:12:01.286182 systemd[1]: Stopped target initrd-fs.target - Initrd File Systems. Mar 21 12:12:01.286192 systemd[1]: Stopped target initrd-root-fs.target - Initrd Root File System. Mar 21 12:12:01.286203 systemd[1]: Reached target integritysetup.target - Local Integrity Protected Volumes. Mar 21 12:12:01.286213 systemd[1]: Reached target remote-cryptsetup.target - Remote Encrypted Volumes. Mar 21 12:12:01.286224 systemd[1]: Reached target remote-fs.target - Remote File Systems. Mar 21 12:12:01.286234 systemd[1]: Reached target slices.target - Slice Units. Mar 21 12:12:01.286244 systemd[1]: Reached target swap.target - Swaps. Mar 21 12:12:01.286254 systemd[1]: Reached target veritysetup.target - Local Verity Protected Volumes. Mar 21 12:12:01.286266 systemd[1]: Listening on systemd-coredump.socket - Process Core Dump Socket. Mar 21 12:12:01.286277 systemd[1]: Listening on systemd-creds.socket - Credential Encryption/Decryption. Mar 21 12:12:01.286287 systemd[1]: Listening on systemd-networkd.socket - Network Service Netlink Socket. Mar 21 12:12:01.286297 systemd[1]: Listening on systemd-udevd-control.socket - udev Control Socket. Mar 21 12:12:01.286308 systemd[1]: Listening on systemd-udevd-kernel.socket - udev Kernel Socket. Mar 21 12:12:01.286318 systemd[1]: Listening on systemd-userdbd.socket - User Database Manager Socket. Mar 21 12:12:01.286329 systemd[1]: Mounting dev-hugepages.mount - Huge Pages File System... Mar 21 12:12:01.286339 systemd[1]: Mounting dev-mqueue.mount - POSIX Message Queue File System... Mar 21 12:12:01.286350 systemd[1]: Mounting media.mount - External Media Directory... Mar 21 12:12:01.286362 systemd[1]: Mounting sys-kernel-debug.mount - Kernel Debug File System... Mar 21 12:12:01.286373 systemd[1]: Mounting sys-kernel-tracing.mount - Kernel Trace File System... Mar 21 12:12:01.286383 systemd[1]: Mounting tmp.mount - Temporary Directory /tmp... Mar 21 12:12:01.286394 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). Mar 21 12:12:01.286404 systemd[1]: Reached target machines.target - Containers. Mar 21 12:12:01.286414 systemd[1]: Starting flatcar-tmpfiles.service - Create missing system files... Mar 21 12:12:01.286424 systemd[1]: ignition-delete-config.service - Ignition (delete config) was skipped because no trigger condition checks were met. Mar 21 12:12:01.286434 systemd[1]: Starting kmod-static-nodes.service - Create List of Static Device Nodes... Mar 21 12:12:01.286446 systemd[1]: Starting modprobe@configfs.service - Load Kernel Module configfs... Mar 21 12:12:01.286456 systemd[1]: Starting modprobe@dm_mod.service - Load Kernel Module dm_mod... Mar 21 12:12:01.286466 systemd[1]: Starting modprobe@drm.service - Load Kernel Module drm... Mar 21 12:12:01.286476 systemd[1]: Starting modprobe@efi_pstore.service - Load Kernel Module efi_pstore... Mar 21 12:12:01.286487 systemd[1]: Starting modprobe@fuse.service - Load Kernel Module fuse... Mar 21 12:12:01.286497 systemd[1]: Starting modprobe@loop.service - Load Kernel Module loop... Mar 21 12:12:01.286507 systemd[1]: setup-nsswitch.service - Create /etc/nsswitch.conf was skipped because of an unmet condition check (ConditionPathExists=!/etc/nsswitch.conf). Mar 21 12:12:01.286517 systemd[1]: systemd-fsck-root.service: Deactivated successfully. Mar 21 12:12:01.286527 systemd[1]: Stopped systemd-fsck-root.service - File System Check on Root Device. Mar 21 12:12:01.286539 systemd[1]: systemd-fsck-usr.service: Deactivated successfully. Mar 21 12:12:01.286549 systemd[1]: Stopped systemd-fsck-usr.service. Mar 21 12:12:01.286559 kernel: fuse: init (API version 7.39) Mar 21 12:12:01.286570 systemd[1]: systemd-hibernate-clear.service - Clear Stale Hibernate Storage Info was skipped because of an unmet condition check (ConditionPathExists=/sys/firmware/efi/efivars/HibernateLocation-8cf2644b-4b0b-428f-9387-6d876050dc67). Mar 21 12:12:01.286581 systemd[1]: Starting systemd-journald.service - Journal Service... Mar 21 12:12:01.286592 systemd[1]: Starting systemd-modules-load.service - Load Kernel Modules... Mar 21 12:12:01.286602 kernel: ACPI: bus type drm_connector registered Mar 21 12:12:01.286611 kernel: loop: module loaded Mar 21 12:12:01.286621 systemd[1]: Starting systemd-network-generator.service - Generate network units from Kernel command line... Mar 21 12:12:01.286633 systemd[1]: Starting systemd-remount-fs.service - Remount Root and Kernel File Systems... Mar 21 12:12:01.286644 systemd[1]: Starting systemd-udev-load-credentials.service - Load udev Rules from Credentials... Mar 21 12:12:01.286655 systemd[1]: Starting systemd-udev-trigger.service - Coldplug All udev Devices... Mar 21 12:12:01.286666 systemd[1]: verity-setup.service: Deactivated successfully. Mar 21 12:12:01.286676 systemd[1]: Stopped verity-setup.service. Mar 21 12:12:01.286688 systemd[1]: Mounted dev-hugepages.mount - Huge Pages File System. Mar 21 12:12:01.286699 systemd[1]: Mounted dev-mqueue.mount - POSIX Message Queue File System. Mar 21 12:12:01.286709 systemd[1]: Mounted media.mount - External Media Directory. Mar 21 12:12:01.286728 systemd[1]: Mounted sys-kernel-debug.mount - Kernel Debug File System. Mar 21 12:12:01.286765 systemd-journald[1112]: Collecting audit messages is disabled. Mar 21 12:12:01.286788 systemd[1]: Mounted sys-kernel-tracing.mount - Kernel Trace File System. Mar 21 12:12:01.286798 systemd[1]: Mounted tmp.mount - Temporary Directory /tmp. Mar 21 12:12:01.286812 systemd[1]: Finished flatcar-tmpfiles.service - Create missing system files. Mar 21 12:12:01.286823 systemd-journald[1112]: Journal started Mar 21 12:12:01.286845 systemd-journald[1112]: Runtime Journal (/run/log/journal/88aa689492c648fca856f90c55b229c7) is 5.9M, max 47.3M, 41.4M free. Mar 21 12:12:01.045252 systemd[1]: Queued start job for default target multi-user.target. Mar 21 12:12:01.064609 systemd[1]: Unnecessary job was removed for dev-vda6.device - /dev/vda6. Mar 21 12:12:01.064982 systemd[1]: systemd-journald.service: Deactivated successfully. Mar 21 12:12:01.289803 systemd[1]: Started systemd-journald.service - Journal Service. Mar 21 12:12:01.291770 systemd[1]: Finished kmod-static-nodes.service - Create List of Static Device Nodes. Mar 21 12:12:01.293355 systemd[1]: modprobe@configfs.service: Deactivated successfully. Mar 21 12:12:01.293538 systemd[1]: Finished modprobe@configfs.service - Load Kernel Module configfs. Mar 21 12:12:01.296082 systemd[1]: modprobe@dm_mod.service: Deactivated successfully. Mar 21 12:12:01.296255 systemd[1]: Finished modprobe@dm_mod.service - Load Kernel Module dm_mod. Mar 21 12:12:01.297622 systemd[1]: modprobe@drm.service: Deactivated successfully. Mar 21 12:12:01.297826 systemd[1]: Finished modprobe@drm.service - Load Kernel Module drm. Mar 21 12:12:01.299212 systemd[1]: modprobe@efi_pstore.service: Deactivated successfully. Mar 21 12:12:01.299381 systemd[1]: Finished modprobe@efi_pstore.service - Load Kernel Module efi_pstore. Mar 21 12:12:01.300934 systemd[1]: modprobe@fuse.service: Deactivated successfully. Mar 21 12:12:01.301095 systemd[1]: Finished modprobe@fuse.service - Load Kernel Module fuse. Mar 21 12:12:01.302520 systemd[1]: modprobe@loop.service: Deactivated successfully. Mar 21 12:12:01.302698 systemd[1]: Finished modprobe@loop.service - Load Kernel Module loop. Mar 21 12:12:01.304157 systemd[1]: Finished systemd-modules-load.service - Load Kernel Modules. Mar 21 12:12:01.305867 systemd[1]: Finished systemd-network-generator.service - Generate network units from Kernel command line. Mar 21 12:12:01.307524 systemd[1]: Finished systemd-remount-fs.service - Remount Root and Kernel File Systems. Mar 21 12:12:01.309338 systemd[1]: Finished systemd-udev-load-credentials.service - Load udev Rules from Credentials. Mar 21 12:12:01.324701 systemd[1]: Reached target network-pre.target - Preparation for Network. Mar 21 12:12:01.327420 systemd[1]: Mounting sys-fs-fuse-connections.mount - FUSE Control File System... Mar 21 12:12:01.329808 systemd[1]: Mounting sys-kernel-config.mount - Kernel Configuration File System... Mar 21 12:12:01.330960 systemd[1]: remount-root.service - Remount Root File System was skipped because of an unmet condition check (ConditionPathIsReadWrite=!/). Mar 21 12:12:01.331000 systemd[1]: Reached target local-fs.target - Local File Systems. Mar 21 12:12:01.333207 systemd[1]: Listening on systemd-sysext.socket - System Extension Image Management. Mar 21 12:12:01.344653 systemd[1]: Starting dracut-shutdown.service - Restore /run/initramfs on shutdown... Mar 21 12:12:01.347041 systemd[1]: Starting ldconfig.service - Rebuild Dynamic Linker Cache... Mar 21 12:12:01.348204 systemd[1]: systemd-binfmt.service - Set Up Additional Binary Formats was skipped because no trigger condition checks were met. Mar 21 12:12:01.349961 systemd[1]: Starting systemd-hwdb-update.service - Rebuild Hardware Database... Mar 21 12:12:01.352073 systemd[1]: Starting systemd-journal-flush.service - Flush Journal to Persistent Storage... Mar 21 12:12:01.353461 systemd[1]: systemd-pstore.service - Platform Persistent Storage Archival was skipped because of an unmet condition check (ConditionDirectoryNotEmpty=/sys/fs/pstore). Mar 21 12:12:01.354502 systemd[1]: Starting systemd-random-seed.service - Load/Save OS Random Seed... Mar 21 12:12:01.355726 systemd[1]: systemd-repart.service - Repartition Root Disk was skipped because no trigger condition checks were met. Mar 21 12:12:01.356676 systemd[1]: Starting systemd-sysctl.service - Apply Kernel Variables... Mar 21 12:12:01.358727 systemd[1]: Starting systemd-sysext.service - Merge System Extension Images into /usr/ and /opt/... Mar 21 12:12:01.363881 systemd[1]: Starting systemd-tmpfiles-setup-dev-early.service - Create Static Device Nodes in /dev gracefully... Mar 21 12:12:01.367093 systemd[1]: Finished systemd-udev-trigger.service - Coldplug All udev Devices. Mar 21 12:12:01.369548 systemd[1]: Mounted sys-fs-fuse-connections.mount - FUSE Control File System. Mar 21 12:12:01.370557 systemd-journald[1112]: Time spent on flushing to /var/log/journal/88aa689492c648fca856f90c55b229c7 is 17.782ms for 833 entries. Mar 21 12:12:01.370557 systemd-journald[1112]: System Journal (/var/log/journal/88aa689492c648fca856f90c55b229c7) is 8M, max 195.6M, 187.6M free. Mar 21 12:12:01.407804 systemd-journald[1112]: Received client request to flush runtime journal. Mar 21 12:12:01.407871 kernel: loop0: detected capacity change from 0 to 126448 Mar 21 12:12:01.372062 systemd[1]: Mounted sys-kernel-config.mount - Kernel Configuration File System. Mar 21 12:12:01.373833 systemd[1]: Finished dracut-shutdown.service - Restore /run/initramfs on shutdown. Mar 21 12:12:01.379999 systemd[1]: Starting systemd-udev-settle.service - Wait for udev To Complete Device Initialization... Mar 21 12:12:01.389349 systemd[1]: Finished systemd-random-seed.service - Load/Save OS Random Seed. Mar 21 12:12:01.391161 systemd[1]: Finished systemd-sysctl.service - Apply Kernel Variables. Mar 21 12:12:01.393573 systemd[1]: Reached target first-boot-complete.target - First Boot Complete. Mar 21 12:12:01.397289 systemd[1]: Starting systemd-machine-id-commit.service - Save Transient machine-id to Disk... Mar 21 12:12:01.406049 udevadm[1170]: systemd-udev-settle.service is deprecated. Please fix lvm2-activation-early.service, lvm2-activation.service not to pull it in. Mar 21 12:12:01.408051 systemd-tmpfiles[1162]: ACLs are not supported, ignoring. Mar 21 12:12:01.408062 systemd-tmpfiles[1162]: ACLs are not supported, ignoring. Mar 21 12:12:01.416305 kernel: squashfs: version 4.0 (2009/01/31) Phillip Lougher Mar 21 12:12:01.415142 systemd[1]: Finished systemd-journal-flush.service - Flush Journal to Persistent Storage. Mar 21 12:12:01.420595 systemd[1]: Finished systemd-tmpfiles-setup-dev-early.service - Create Static Device Nodes in /dev gracefully. Mar 21 12:12:01.425409 systemd[1]: Starting systemd-sysusers.service - Create System Users... Mar 21 12:12:01.441429 systemd[1]: Finished systemd-machine-id-commit.service - Save Transient machine-id to Disk. Mar 21 12:12:01.457426 kernel: loop1: detected capacity change from 0 to 103832 Mar 21 12:12:01.465290 systemd[1]: Finished systemd-sysusers.service - Create System Users. Mar 21 12:12:01.468267 systemd[1]: Starting systemd-tmpfiles-setup-dev.service - Create Static Device Nodes in /dev... Mar 21 12:12:01.490769 kernel: loop2: detected capacity change from 0 to 126448 Mar 21 12:12:01.491892 systemd-tmpfiles[1186]: ACLs are not supported, ignoring. Mar 21 12:12:01.491904 systemd-tmpfiles[1186]: ACLs are not supported, ignoring. Mar 21 12:12:01.495900 systemd[1]: Finished systemd-tmpfiles-setup-dev.service - Create Static Device Nodes in /dev. Mar 21 12:12:01.496828 kernel: loop3: detected capacity change from 0 to 103832 Mar 21 12:12:01.502267 (sd-merge)[1188]: Using extensions 'containerd-flatcar', 'docker-flatcar'. Mar 21 12:12:01.502637 (sd-merge)[1188]: Merged extensions into '/usr'. Mar 21 12:12:01.504601 systemd[1]: Finished systemd-sysext.service - Merge System Extension Images into /usr/ and /opt/. Mar 21 12:12:01.508096 systemd[1]: Starting ensure-sysext.service... Mar 21 12:12:01.512905 systemd[1]: Starting systemd-tmpfiles-setup.service - Create System Files and Directories... Mar 21 12:12:01.535960 systemd[1]: Reload requested from client PID 1191 ('systemctl') (unit ensure-sysext.service)... Mar 21 12:12:01.536158 systemd[1]: Reloading... Mar 21 12:12:01.537042 systemd-tmpfiles[1192]: /usr/lib/tmpfiles.d/provision.conf:20: Duplicate line for path "/root", ignoring. Mar 21 12:12:01.537257 systemd-tmpfiles[1192]: /usr/lib/tmpfiles.d/systemd-flatcar.conf:6: Duplicate line for path "/var/log/journal", ignoring. Mar 21 12:12:01.539277 systemd-tmpfiles[1192]: /usr/lib/tmpfiles.d/systemd.conf:29: Duplicate line for path "/var/lib/systemd", ignoring. Mar 21 12:12:01.540222 systemd-tmpfiles[1192]: ACLs are not supported, ignoring. Mar 21 12:12:01.540277 systemd-tmpfiles[1192]: ACLs are not supported, ignoring. Mar 21 12:12:01.542867 systemd-tmpfiles[1192]: Detected autofs mount point /boot during canonicalization of boot. Mar 21 12:12:01.542880 systemd-tmpfiles[1192]: Skipping /boot Mar 21 12:12:01.552896 systemd-tmpfiles[1192]: Detected autofs mount point /boot during canonicalization of boot. Mar 21 12:12:01.552912 systemd-tmpfiles[1192]: Skipping /boot Mar 21 12:12:01.581771 zram_generator::config[1223]: No configuration found. Mar 21 12:12:01.673227 ldconfig[1156]: /sbin/ldconfig: /usr/lib/ld.so.conf is not an ELF file - it has the wrong magic bytes at the start. Mar 21 12:12:01.682800 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. Mar 21 12:12:01.732006 systemd[1]: etc-machine\x2did.mount: Deactivated successfully. Mar 21 12:12:01.732455 systemd[1]: Reloading finished in 195 ms. Mar 21 12:12:01.752426 systemd[1]: Finished ldconfig.service - Rebuild Dynamic Linker Cache. Mar 21 12:12:01.755951 systemd[1]: Finished systemd-tmpfiles-setup.service - Create System Files and Directories. Mar 21 12:12:01.780036 systemd[1]: Starting audit-rules.service - Load Audit Rules... Mar 21 12:12:01.782714 systemd[1]: Starting clean-ca-certificates.service - Clean up broken links in /etc/ssl/certs... Mar 21 12:12:01.797026 systemd[1]: Starting systemd-journal-catalog-update.service - Rebuild Journal Catalog... Mar 21 12:12:01.802525 systemd[1]: Starting systemd-resolved.service - Network Name Resolution... Mar 21 12:12:01.805147 systemd[1]: Starting systemd-update-utmp.service - Record System Boot/Shutdown in UTMP... Mar 21 12:12:01.808512 systemd[1]: ignition-delete-config.service - Ignition (delete config) was skipped because no trigger condition checks were met. Mar 21 12:12:01.813568 systemd[1]: Starting modprobe@dm_mod.service - Load Kernel Module dm_mod... Mar 21 12:12:01.819286 systemd[1]: Starting modprobe@efi_pstore.service - Load Kernel Module efi_pstore... Mar 21 12:12:01.822286 systemd[1]: Starting modprobe@loop.service - Load Kernel Module loop... Mar 21 12:12:01.825915 systemd[1]: systemd-binfmt.service - Set Up Additional Binary Formats was skipped because no trigger condition checks were met. Mar 21 12:12:01.826060 systemd[1]: systemd-hibernate-clear.service - Clear Stale Hibernate Storage Info was skipped because of an unmet condition check (ConditionPathExists=/sys/firmware/efi/efivars/HibernateLocation-8cf2644b-4b0b-428f-9387-6d876050dc67). Mar 21 12:12:01.829418 systemd[1]: modprobe@dm_mod.service: Deactivated successfully. Mar 21 12:12:01.829590 systemd[1]: Finished modprobe@dm_mod.service - Load Kernel Module dm_mod. Mar 21 12:12:01.831382 systemd[1]: modprobe@efi_pstore.service: Deactivated successfully. Mar 21 12:12:01.831531 systemd[1]: Finished modprobe@efi_pstore.service - Load Kernel Module efi_pstore. Mar 21 12:12:01.833479 systemd[1]: modprobe@loop.service: Deactivated successfully. Mar 21 12:12:01.833634 systemd[1]: Finished modprobe@loop.service - Load Kernel Module loop. Mar 21 12:12:01.842775 systemd[1]: Finished systemd-update-utmp.service - Record System Boot/Shutdown in UTMP. Mar 21 12:12:01.847609 systemd[1]: ignition-delete-config.service - Ignition (delete config) was skipped because no trigger condition checks were met. Mar 21 12:12:01.849390 systemd[1]: Starting modprobe@dm_mod.service - Load Kernel Module dm_mod... Mar 21 12:12:01.851416 systemd[1]: Starting modprobe@drm.service - Load Kernel Module drm... Mar 21 12:12:01.855886 systemd[1]: Starting modprobe@efi_pstore.service - Load Kernel Module efi_pstore... Mar 21 12:12:01.863575 systemd[1]: Starting modprobe@loop.service - Load Kernel Module loop... Mar 21 12:12:01.864810 systemd[1]: systemd-binfmt.service - Set Up Additional Binary Formats was skipped because no trigger condition checks were met. Mar 21 12:12:01.864856 systemd[1]: systemd-hibernate-clear.service - Clear Stale Hibernate Storage Info was skipped because of an unmet condition check (ConditionPathExists=/sys/firmware/efi/efivars/HibernateLocation-8cf2644b-4b0b-428f-9387-6d876050dc67). Mar 21 12:12:01.867035 systemd[1]: Starting systemd-userdbd.service - User Database Manager... Mar 21 12:12:01.868689 systemd[1]: Finished ensure-sysext.service. Mar 21 12:12:01.872653 systemd[1]: Finished clean-ca-certificates.service - Clean up broken links in /etc/ssl/certs. Mar 21 12:12:01.874577 systemd[1]: modprobe@dm_mod.service: Deactivated successfully. Mar 21 12:12:01.874763 systemd[1]: Finished modprobe@dm_mod.service - Load Kernel Module dm_mod. Mar 21 12:12:01.876215 systemd[1]: modprobe@drm.service: Deactivated successfully. Mar 21 12:12:01.876368 systemd[1]: Finished modprobe@drm.service - Load Kernel Module drm. Mar 21 12:12:01.880602 systemd[1]: modprobe@efi_pstore.service: Deactivated successfully. Mar 21 12:12:01.880781 systemd[1]: Finished modprobe@efi_pstore.service - Load Kernel Module efi_pstore. Mar 21 12:12:01.882391 systemd[1]: modprobe@loop.service: Deactivated successfully. Mar 21 12:12:01.882656 systemd[1]: Finished modprobe@loop.service - Load Kernel Module loop. Mar 21 12:12:01.891314 systemd[1]: systemd-pstore.service - Platform Persistent Storage Archival was skipped because of an unmet condition check (ConditionDirectoryNotEmpty=/sys/fs/pstore). Mar 21 12:12:01.891501 systemd[1]: systemd-repart.service - Repartition Root Disk was skipped because no trigger condition checks were met. Mar 21 12:12:01.899370 systemd[1]: Starting systemd-timesyncd.service - Network Time Synchronization... Mar 21 12:12:01.900537 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). Mar 21 12:12:01.900977 systemd[1]: Finished systemd-hwdb-update.service - Rebuild Hardware Database. Mar 21 12:12:01.902386 systemd[1]: Finished systemd-journal-catalog-update.service - Rebuild Journal Catalog. Mar 21 12:12:01.906453 systemd[1]: Starting systemd-udevd.service - Rule-based Manager for Device Events and Files... Mar 21 12:12:01.910687 systemd[1]: Starting systemd-update-done.service - Update is Completed... Mar 21 12:12:01.913353 augenrules[1305]: No rules Mar 21 12:12:01.931105 systemd[1]: Started systemd-userdbd.service - User Database Manager. Mar 21 12:12:01.932667 systemd[1]: audit-rules.service: Deactivated successfully. Mar 21 12:12:01.934762 systemd[1]: Finished audit-rules.service - Load Audit Rules. Mar 21 12:12:01.943042 systemd[1]: Finished systemd-update-done.service - Update is Completed. Mar 21 12:12:01.961282 systemd-udevd[1302]: Using default interface naming scheme 'v255'. Mar 21 12:12:01.977895 systemd[1]: Started systemd-udevd.service - Rule-based Manager for Device Events and Files. Mar 21 12:12:01.984641 systemd[1]: Starting systemd-networkd.service - Network Configuration... Mar 21 12:12:01.986494 systemd[1]: Started systemd-timesyncd.service - Network Time Synchronization. Mar 21 12:12:01.991799 systemd-resolved[1262]: Positive Trust Anchors: Mar 21 12:12:01.991819 systemd-resolved[1262]: . IN DS 20326 8 2 e06d44b80b8f1d39a95c0b0d7c65d08458e880409bbc683457104237c7f8ec8d Mar 21 12:12:01.991850 systemd-resolved[1262]: 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 Mar 21 12:12:01.991910 systemd[1]: Reached target time-set.target - System Time Set. Mar 21 12:12:02.001041 systemd-resolved[1262]: Defaulting to hostname 'linux'. Mar 21 12:12:02.007884 systemd[1]: Started systemd-resolved.service - Network Name Resolution. Mar 21 12:12:02.011322 systemd[1]: Condition check resulted in dev-ttyAMA0.device - /dev/ttyAMA0 being skipped. Mar 21 12:12:02.011838 systemd[1]: Reached target nss-lookup.target - Host and Network Name Lookups. Mar 21 12:12:02.041765 kernel: BTRFS warning: duplicate device /dev/vda3 devid 1 generation 39 scanned by (udev-worker) (1332) Mar 21 12:12:02.067051 systemd[1]: Found device dev-disk-by\x2dlabel-OEM.device - /dev/disk/by-label/OEM. Mar 21 12:12:02.072013 systemd[1]: Starting systemd-fsck@dev-disk-by\x2dlabel-OEM.service - File System Check on /dev/disk/by-label/OEM... Mar 21 12:12:02.118062 systemd[1]: Finished systemd-fsck@dev-disk-by\x2dlabel-OEM.service - File System Check on /dev/disk/by-label/OEM. Mar 21 12:12:02.123699 systemd-networkd[1328]: lo: Link UP Mar 21 12:12:02.123706 systemd-networkd[1328]: lo: Gained carrier Mar 21 12:12:02.124590 systemd-networkd[1328]: Enumeration completed Mar 21 12:12:02.124705 systemd[1]: Started systemd-networkd.service - Network Configuration. Mar 21 12:12:02.126524 systemd[1]: Reached target network.target - Network. Mar 21 12:12:02.126831 systemd-networkd[1328]: eth0: found matching network '/usr/lib/systemd/network/zz-default.network', based on potentially unpredictable interface name. Mar 21 12:12:02.126839 systemd-networkd[1328]: eth0: Configuring with /usr/lib/systemd/network/zz-default.network. Mar 21 12:12:02.127331 systemd-networkd[1328]: eth0: Link UP Mar 21 12:12:02.127338 systemd-networkd[1328]: eth0: Gained carrier Mar 21 12:12:02.127351 systemd-networkd[1328]: eth0: found matching network '/usr/lib/systemd/network/zz-default.network', based on potentially unpredictable interface name. Mar 21 12:12:02.128991 systemd[1]: Starting systemd-networkd-persistent-storage.service - Enable Persistent Storage in systemd-networkd... Mar 21 12:12:02.132858 systemd[1]: Starting systemd-networkd-wait-online.service - Wait for Network to be Configured... Mar 21 12:12:02.145728 systemd[1]: Starting systemd-vconsole-setup.service - Virtual Console Setup... Mar 21 12:12:02.148811 systemd-networkd[1328]: eth0: DHCPv4 address 10.0.0.4/16, gateway 10.0.0.1 acquired from 10.0.0.1 Mar 21 12:12:02.149994 systemd-timesyncd[1298]: Network configuration changed, trying to establish connection. Mar 21 12:12:02.150823 systemd-timesyncd[1298]: Contacted time server 10.0.0.1:123 (10.0.0.1). Mar 21 12:12:02.150897 systemd-timesyncd[1298]: Initial clock synchronization to Fri 2025-03-21 12:12:01.812548 UTC. Mar 21 12:12:02.156153 systemd[1]: Finished systemd-networkd-persistent-storage.service - Enable Persistent Storage in systemd-networkd. Mar 21 12:12:02.158998 systemd[1]: Finished systemd-udev-settle.service - Wait for udev To Complete Device Initialization. Mar 21 12:12:02.163210 systemd[1]: Starting lvm2-activation-early.service - Activation of LVM2 logical volumes... Mar 21 12:12:02.193621 lvm[1359]: WARNING: Failed to connect to lvmetad. Falling back to device scanning. Mar 21 12:12:02.196780 systemd[1]: Finished systemd-vconsole-setup.service - Virtual Console Setup. Mar 21 12:12:02.227103 systemd[1]: Finished lvm2-activation-early.service - Activation of LVM2 logical volumes. Mar 21 12:12:02.228629 systemd[1]: Reached target cryptsetup.target - Local Encrypted Volumes. Mar 21 12:12:02.230891 systemd[1]: Reached target sysinit.target - System Initialization. Mar 21 12:12:02.232078 systemd[1]: Started motdgen.path - Watch for update engine configuration changes. Mar 21 12:12:02.233348 systemd[1]: Started user-cloudinit@var-lib-flatcar\x2dinstall-user_data.path - Watch for a cloud-config at /var/lib/flatcar-install/user_data. Mar 21 12:12:02.234807 systemd[1]: Started logrotate.timer - Daily rotation of log files. Mar 21 12:12:02.236096 systemd[1]: Started mdadm.timer - Weekly check for MD array's redundancy information.. Mar 21 12:12:02.237365 systemd[1]: Started systemd-tmpfiles-clean.timer - Daily Cleanup of Temporary Directories. Mar 21 12:12:02.238648 systemd[1]: update-engine-stub.timer - Update Engine Stub Timer was skipped because of an unmet condition check (ConditionPathExists=/usr/.noupdate). Mar 21 12:12:02.238685 systemd[1]: Reached target paths.target - Path Units. Mar 21 12:12:02.239647 systemd[1]: Reached target timers.target - Timer Units. Mar 21 12:12:02.241511 systemd[1]: Listening on dbus.socket - D-Bus System Message Bus Socket. Mar 21 12:12:02.244019 systemd[1]: Starting docker.socket - Docker Socket for the API... Mar 21 12:12:02.247152 systemd[1]: Listening on sshd-unix-local.socket - OpenSSH Server Socket (systemd-ssh-generator, AF_UNIX Local). Mar 21 12:12:02.248726 systemd[1]: Listening on sshd-vsock.socket - OpenSSH Server Socket (systemd-ssh-generator, AF_VSOCK). Mar 21 12:12:02.250069 systemd[1]: Reached target ssh-access.target - SSH Access Available. Mar 21 12:12:02.254757 systemd[1]: Listening on sshd.socket - OpenSSH Server Socket. Mar 21 12:12:02.256300 systemd[1]: Listening on systemd-hostnamed.socket - Hostname Service Socket. Mar 21 12:12:02.258834 systemd[1]: Starting lvm2-activation.service - Activation of LVM2 logical volumes... Mar 21 12:12:02.260970 systemd[1]: Listening on docker.socket - Docker Socket for the API. Mar 21 12:12:02.262284 systemd[1]: Reached target sockets.target - Socket Units. Mar 21 12:12:02.263285 systemd[1]: Reached target basic.target - Basic System. Mar 21 12:12:02.264332 systemd[1]: addon-config@oem.service - Configure Addon /oem was skipped because no trigger condition checks were met. Mar 21 12:12:02.264367 systemd[1]: addon-run@oem.service - Run Addon /oem was skipped because no trigger condition checks were met. Mar 21 12:12:02.265367 systemd[1]: Starting containerd.service - containerd container runtime... Mar 21 12:12:02.267436 lvm[1366]: WARNING: Failed to connect to lvmetad. Falling back to device scanning. Mar 21 12:12:02.267893 systemd[1]: Starting dbus.service - D-Bus System Message Bus... Mar 21 12:12:02.272862 systemd[1]: Starting enable-oem-cloudinit.service - Enable cloudinit... Mar 21 12:12:02.275273 systemd[1]: Starting extend-filesystems.service - Extend Filesystems... Mar 21 12:12:02.276402 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). Mar 21 12:12:02.277499 systemd[1]: Starting motdgen.service - Generate /run/flatcar/motd... Mar 21 12:12:02.282832 systemd[1]: Starting ssh-key-proc-cmdline.service - Install an ssh key from /proc/cmdline... Mar 21 12:12:02.285348 systemd[1]: Starting sshd-keygen.service - Generate sshd host keys... Mar 21 12:12:02.297944 systemd[1]: Starting systemd-logind.service - User Login Management... Mar 21 12:12:02.299908 systemd[1]: tcsd.service - TCG Core Services Daemon was skipped because of an unmet condition check (ConditionPathExists=/dev/tpm0). Mar 21 12:12:02.300431 systemd[1]: cgroup compatibility translation between legacy and unified hierarchy settings activated. See cgroup-compat debug messages for details. Mar 21 12:12:02.301226 systemd[1]: Starting update-engine.service - Update Engine... Mar 21 12:12:02.301620 jq[1369]: false Mar 21 12:12:02.305203 systemd[1]: Starting update-ssh-keys-after-ignition.service - Run update-ssh-keys once after Ignition... Mar 21 12:12:02.312081 dbus-daemon[1368]: [system] SELinux support is enabled Mar 21 12:12:02.307306 systemd[1]: Finished lvm2-activation.service - Activation of LVM2 logical volumes. Mar 21 12:12:02.317016 systemd[1]: Started dbus.service - D-Bus System Message Bus. Mar 21 12:12:02.319720 extend-filesystems[1370]: Found loop2 Mar 21 12:12:02.320188 systemd[1]: enable-oem-cloudinit.service: Skipped due to 'exec-condition'. Mar 21 12:12:02.320367 systemd[1]: Condition check resulted in enable-oem-cloudinit.service - Enable cloudinit being skipped. Mar 21 12:12:02.320653 systemd[1]: motdgen.service: Deactivated successfully. Mar 21 12:12:02.320839 systemd[1]: Finished motdgen.service - Generate /run/flatcar/motd. Mar 21 12:12:02.321260 extend-filesystems[1370]: Found loop3 Mar 21 12:12:02.324513 extend-filesystems[1370]: Found vda Mar 21 12:12:02.324513 extend-filesystems[1370]: Found vda1 Mar 21 12:12:02.324513 extend-filesystems[1370]: Found vda2 Mar 21 12:12:02.324513 extend-filesystems[1370]: Found vda3 Mar 21 12:12:02.324513 extend-filesystems[1370]: Found usr Mar 21 12:12:02.324513 extend-filesystems[1370]: Found vda4 Mar 21 12:12:02.324513 extend-filesystems[1370]: Found vda6 Mar 21 12:12:02.324513 extend-filesystems[1370]: Found vda7 Mar 21 12:12:02.324513 extend-filesystems[1370]: Found vda9 Mar 21 12:12:02.324513 extend-filesystems[1370]: Checking size of /dev/vda9 Mar 21 12:12:02.322485 systemd[1]: ssh-key-proc-cmdline.service: Deactivated successfully. Mar 21 12:12:02.339146 jq[1384]: true Mar 21 12:12:02.323784 systemd[1]: Finished ssh-key-proc-cmdline.service - Install an ssh key from /proc/cmdline. Mar 21 12:12:02.337704 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). Mar 21 12:12:02.339181 systemd[1]: Reached target system-config.target - Load system-provided cloud configs. Mar 21 12:12:02.340620 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). Mar 21 12:12:02.340648 systemd[1]: Reached target user-config.target - Load user-provided cloud configs. Mar 21 12:12:02.361766 jq[1388]: true Mar 21 12:12:02.362810 extend-filesystems[1370]: Old size kept for /dev/vda9 Mar 21 12:12:02.369909 systemd[1]: extend-filesystems.service: Deactivated successfully. Mar 21 12:12:02.370149 systemd[1]: Finished extend-filesystems.service - Extend Filesystems. Mar 21 12:12:02.371819 update_engine[1382]: I20250321 12:12:02.371608 1382 main.cc:92] Flatcar Update Engine starting Mar 21 12:12:02.375519 update_engine[1382]: I20250321 12:12:02.375473 1382 update_check_scheduler.cc:74] Next update check in 10m55s Mar 21 12:12:02.384762 kernel: BTRFS warning: duplicate device /dev/vda3 devid 1 generation 39 scanned by (udev-worker) (1333) Mar 21 12:12:02.388598 systemd[1]: Started update-engine.service - Update Engine. Mar 21 12:12:02.397154 (ntainerd)[1400]: containerd.service: Referenced but unset environment variable evaluates to an empty string: TORCX_IMAGEDIR, TORCX_UNPACKDIR Mar 21 12:12:02.402871 systemd-logind[1379]: Watching system buttons on /dev/input/event0 (Power Button) Mar 21 12:12:02.404579 systemd-logind[1379]: New seat seat0. Mar 21 12:12:02.407280 systemd[1]: Started locksmithd.service - Cluster reboot manager. Mar 21 12:12:02.410293 systemd[1]: Started systemd-logind.service - User Login Management. Mar 21 12:12:02.421878 bash[1419]: Updated "/home/core/.ssh/authorized_keys" Mar 21 12:12:02.426825 systemd[1]: Finished update-ssh-keys-after-ignition.service - Run update-ssh-keys once after Ignition. Mar 21 12:12:02.429010 systemd[1]: sshkeys.service was skipped because no trigger condition checks were met. Mar 21 12:12:02.469582 locksmithd[1420]: locksmithd starting currentOperation="UPDATE_STATUS_IDLE" strategy="reboot" Mar 21 12:12:02.615209 containerd[1400]: time="2025-03-21T12:12:02Z" level=warning msg="Ignoring unknown key in TOML" column=1 error="strict mode: fields in the document are missing in the target struct" file=/usr/share/containerd/config.toml key=subreaper row=8 Mar 21 12:12:02.616650 containerd[1400]: time="2025-03-21T12:12:02.616599800Z" level=info msg="starting containerd" revision=88aa2f531d6c2922003cc7929e51daf1c14caa0a version=v2.0.1 Mar 21 12:12:02.625440 containerd[1400]: time="2025-03-21T12:12:02.625396040Z" level=warning msg="Configuration migrated from version 2, use `containerd config migrate` to avoid migration" t="6.2µs" Mar 21 12:12:02.625440 containerd[1400]: time="2025-03-21T12:12:02.625432840Z" level=info msg="loading plugin" id=io.containerd.image-verifier.v1.bindir type=io.containerd.image-verifier.v1 Mar 21 12:12:02.625506 containerd[1400]: time="2025-03-21T12:12:02.625451080Z" level=info msg="loading plugin" id=io.containerd.internal.v1.opt type=io.containerd.internal.v1 Mar 21 12:12:02.625625 containerd[1400]: time="2025-03-21T12:12:02.625595400Z" level=info msg="loading plugin" id=io.containerd.warning.v1.deprecations type=io.containerd.warning.v1 Mar 21 12:12:02.625625 containerd[1400]: time="2025-03-21T12:12:02.625620320Z" level=info msg="loading plugin" id=io.containerd.content.v1.content type=io.containerd.content.v1 Mar 21 12:12:02.625727 containerd[1400]: time="2025-03-21T12:12:02.625652160Z" level=info msg="loading plugin" id=io.containerd.snapshotter.v1.blockfile type=io.containerd.snapshotter.v1 Mar 21 12:12:02.625727 containerd[1400]: time="2025-03-21T12:12:02.625702280Z" level=info msg="skip loading plugin" error="no scratch file generator: skip plugin" id=io.containerd.snapshotter.v1.blockfile type=io.containerd.snapshotter.v1 Mar 21 12:12:02.625727 containerd[1400]: time="2025-03-21T12:12:02.625723400Z" level=info msg="loading plugin" id=io.containerd.snapshotter.v1.btrfs type=io.containerd.snapshotter.v1 Mar 21 12:12:02.626062 containerd[1400]: time="2025-03-21T12:12:02.626021760Z" level=info msg="skip loading plugin" error="path /var/lib/containerd/io.containerd.snapshotter.v1.btrfs (ext4) must be a btrfs filesystem to be used with the btrfs snapshotter: skip plugin" id=io.containerd.snapshotter.v1.btrfs type=io.containerd.snapshotter.v1 Mar 21 12:12:02.626062 containerd[1400]: time="2025-03-21T12:12:02.626049960Z" level=info msg="loading plugin" id=io.containerd.snapshotter.v1.devmapper type=io.containerd.snapshotter.v1 Mar 21 12:12:02.626104 containerd[1400]: time="2025-03-21T12:12:02.626067400Z" level=info msg="skip loading plugin" error="devmapper not configured: skip plugin" id=io.containerd.snapshotter.v1.devmapper type=io.containerd.snapshotter.v1 Mar 21 12:12:02.626104 containerd[1400]: time="2025-03-21T12:12:02.626076000Z" level=info msg="loading plugin" id=io.containerd.snapshotter.v1.native type=io.containerd.snapshotter.v1 Mar 21 12:12:02.626170 containerd[1400]: time="2025-03-21T12:12:02.626153160Z" level=info msg="loading plugin" id=io.containerd.snapshotter.v1.overlayfs type=io.containerd.snapshotter.v1 Mar 21 12:12:02.626418 containerd[1400]: time="2025-03-21T12:12:02.626389080Z" level=info msg="loading plugin" id=io.containerd.snapshotter.v1.zfs type=io.containerd.snapshotter.v1 Mar 21 12:12:02.626451 containerd[1400]: time="2025-03-21T12:12:02.626426520Z" level=info msg="skip loading plugin" error="lstat /var/lib/containerd/io.containerd.snapshotter.v1.zfs: no such file or directory: skip plugin" id=io.containerd.snapshotter.v1.zfs type=io.containerd.snapshotter.v1 Mar 21 12:12:02.626451 containerd[1400]: time="2025-03-21T12:12:02.626437080Z" level=info msg="loading plugin" id=io.containerd.event.v1.exchange type=io.containerd.event.v1 Mar 21 12:12:02.627434 containerd[1400]: time="2025-03-21T12:12:02.627396680Z" level=info msg="loading plugin" id=io.containerd.monitor.task.v1.cgroups type=io.containerd.monitor.task.v1 Mar 21 12:12:02.628298 containerd[1400]: time="2025-03-21T12:12:02.628104040Z" level=info msg="loading plugin" id=io.containerd.metadata.v1.bolt type=io.containerd.metadata.v1 Mar 21 12:12:02.628298 containerd[1400]: time="2025-03-21T12:12:02.628201640Z" level=info msg="metadata content store policy set" policy=shared Mar 21 12:12:02.631729 containerd[1400]: time="2025-03-21T12:12:02.631694520Z" level=info msg="loading plugin" id=io.containerd.gc.v1.scheduler type=io.containerd.gc.v1 Mar 21 12:12:02.631793 containerd[1400]: time="2025-03-21T12:12:02.631757920Z" level=info msg="loading plugin" id=io.containerd.differ.v1.walking type=io.containerd.differ.v1 Mar 21 12:12:02.631793 containerd[1400]: time="2025-03-21T12:12:02.631780120Z" level=info msg="loading plugin" id=io.containerd.lease.v1.manager type=io.containerd.lease.v1 Mar 21 12:12:02.631848 containerd[1400]: time="2025-03-21T12:12:02.631792880Z" level=info msg="loading plugin" id=io.containerd.service.v1.containers-service type=io.containerd.service.v1 Mar 21 12:12:02.631848 containerd[1400]: time="2025-03-21T12:12:02.631805520Z" level=info msg="loading plugin" id=io.containerd.service.v1.content-service type=io.containerd.service.v1 Mar 21 12:12:02.631848 containerd[1400]: time="2025-03-21T12:12:02.631817560Z" level=info msg="loading plugin" id=io.containerd.service.v1.diff-service type=io.containerd.service.v1 Mar 21 12:12:02.631848 containerd[1400]: time="2025-03-21T12:12:02.631829520Z" level=info msg="loading plugin" id=io.containerd.service.v1.images-service type=io.containerd.service.v1 Mar 21 12:12:02.631848 containerd[1400]: time="2025-03-21T12:12:02.631841640Z" level=info msg="loading plugin" id=io.containerd.service.v1.introspection-service type=io.containerd.service.v1 Mar 21 12:12:02.631932 containerd[1400]: time="2025-03-21T12:12:02.631851800Z" level=info msg="loading plugin" id=io.containerd.service.v1.namespaces-service type=io.containerd.service.v1 Mar 21 12:12:02.631932 containerd[1400]: time="2025-03-21T12:12:02.631861800Z" level=info msg="loading plugin" id=io.containerd.service.v1.snapshots-service type=io.containerd.service.v1 Mar 21 12:12:02.631932 containerd[1400]: time="2025-03-21T12:12:02.631871400Z" level=info msg="loading plugin" id=io.containerd.shim.v1.manager type=io.containerd.shim.v1 Mar 21 12:12:02.631932 containerd[1400]: time="2025-03-21T12:12:02.631882480Z" level=info msg="loading plugin" id=io.containerd.runtime.v2.task type=io.containerd.runtime.v2 Mar 21 12:12:02.632047 containerd[1400]: time="2025-03-21T12:12:02.631995000Z" level=info msg="loading plugin" id=io.containerd.service.v1.tasks-service type=io.containerd.service.v1 Mar 21 12:12:02.632047 containerd[1400]: time="2025-03-21T12:12:02.632024720Z" level=info msg="loading plugin" id=io.containerd.grpc.v1.containers type=io.containerd.grpc.v1 Mar 21 12:12:02.632047 containerd[1400]: time="2025-03-21T12:12:02.632039400Z" level=info msg="loading plugin" id=io.containerd.grpc.v1.content type=io.containerd.grpc.v1 Mar 21 12:12:02.632109 containerd[1400]: time="2025-03-21T12:12:02.632050720Z" level=info msg="loading plugin" id=io.containerd.grpc.v1.diff type=io.containerd.grpc.v1 Mar 21 12:12:02.632109 containerd[1400]: time="2025-03-21T12:12:02.632062040Z" level=info msg="loading plugin" id=io.containerd.grpc.v1.events type=io.containerd.grpc.v1 Mar 21 12:12:02.632109 containerd[1400]: time="2025-03-21T12:12:02.632072840Z" level=info msg="loading plugin" id=io.containerd.grpc.v1.images type=io.containerd.grpc.v1 Mar 21 12:12:02.632109 containerd[1400]: time="2025-03-21T12:12:02.632090040Z" level=info msg="loading plugin" id=io.containerd.grpc.v1.introspection type=io.containerd.grpc.v1 Mar 21 12:12:02.632109 containerd[1400]: time="2025-03-21T12:12:02.632103760Z" level=info msg="loading plugin" id=io.containerd.grpc.v1.leases type=io.containerd.grpc.v1 Mar 21 12:12:02.632192 containerd[1400]: time="2025-03-21T12:12:02.632115000Z" level=info msg="loading plugin" id=io.containerd.grpc.v1.namespaces type=io.containerd.grpc.v1 Mar 21 12:12:02.632192 containerd[1400]: time="2025-03-21T12:12:02.632125960Z" level=info msg="loading plugin" id=io.containerd.sandbox.store.v1.local type=io.containerd.sandbox.store.v1 Mar 21 12:12:02.632192 containerd[1400]: time="2025-03-21T12:12:02.632136520Z" level=info msg="loading plugin" id=io.containerd.cri.v1.images type=io.containerd.cri.v1 Mar 21 12:12:02.632401 containerd[1400]: time="2025-03-21T12:12:02.632385040Z" level=info msg="Get image filesystem path \"/var/lib/containerd/io.containerd.snapshotter.v1.overlayfs\" for snapshotter \"overlayfs\"" Mar 21 12:12:02.632440 containerd[1400]: time="2025-03-21T12:12:02.632403960Z" level=info msg="Start snapshots syncer" Mar 21 12:12:02.632440 containerd[1400]: time="2025-03-21T12:12:02.632435440Z" level=info msg="loading plugin" id=io.containerd.cri.v1.runtime type=io.containerd.cri.v1 Mar 21 12:12:02.632667 containerd[1400]: time="2025-03-21T12:12:02.632635560Z" level=info msg="starting cri plugin" config="{\"containerd\":{\"defaultRuntimeName\":\"runc\",\"runtimes\":{\"runc\":{\"runtimeType\":\"io.containerd.runc.v2\",\"runtimePath\":\"\",\"PodAnnotations\":null,\"ContainerAnnotations\":null,\"options\":{\"BinaryName\":\"\",\"CriuImagePath\":\"\",\"CriuWorkPath\":\"\",\"IoGid\":0,\"IoUid\":0,\"NoNewKeyring\":false,\"Root\":\"\",\"ShimCgroup\":\"\",\"SystemdCgroup\":true},\"privileged_without_host_devices\":false,\"privileged_without_host_devices_all_devices_allowed\":false,\"baseRuntimeSpec\":\"\",\"cniConfDir\":\"\",\"cniMaxConfNum\":0,\"snapshotter\":\"\",\"sandboxer\":\"podsandbox\",\"io_type\":\"\"}},\"ignoreBlockIONotEnabledErrors\":false,\"ignoreRdtNotEnabledErrors\":false},\"cni\":{\"binDir\":\"/opt/cni/bin\",\"confDir\":\"/etc/cni/net.d\",\"maxConfNum\":1,\"setupSerially\":false,\"confTemplate\":\"\",\"ipPref\":\"\",\"useInternalLoopback\":false},\"enableSelinux\":true,\"selinuxCategoryRange\":1024,\"maxContainerLogSize\":16384,\"disableApparmor\":false,\"restrictOOMScoreAdj\":false,\"disableProcMount\":false,\"unsetSeccompProfile\":\"\",\"tolerateMissingHugetlbController\":true,\"disableHugetlbController\":true,\"device_ownership_from_security_context\":false,\"ignoreImageDefinedVolumes\":false,\"netnsMountsUnderStateDir\":false,\"enableUnprivilegedPorts\":true,\"enableUnprivilegedICMP\":true,\"enableCDI\":true,\"cdiSpecDirs\":[\"/etc/cdi\",\"/var/run/cdi\"],\"drainExecSyncIOTimeout\":\"0s\",\"ignoreDeprecationWarnings\":null,\"containerdRootDir\":\"/var/lib/containerd\",\"containerdEndpoint\":\"/run/containerd/containerd.sock\",\"rootDir\":\"/var/lib/containerd/io.containerd.grpc.v1.cri\",\"stateDir\":\"/run/containerd/io.containerd.grpc.v1.cri\"}" Mar 21 12:12:02.632784 containerd[1400]: time="2025-03-21T12:12:02.632685880Z" level=info msg="loading plugin" id=io.containerd.podsandbox.controller.v1.podsandbox type=io.containerd.podsandbox.controller.v1 Mar 21 12:12:02.632849 containerd[1400]: time="2025-03-21T12:12:02.632799640Z" level=info msg="loading plugin" id=io.containerd.sandbox.controller.v1.shim type=io.containerd.sandbox.controller.v1 Mar 21 12:12:02.632941 containerd[1400]: time="2025-03-21T12:12:02.632920680Z" level=info msg="loading plugin" id=io.containerd.grpc.v1.sandbox-controllers type=io.containerd.grpc.v1 Mar 21 12:12:02.632967 containerd[1400]: time="2025-03-21T12:12:02.632951080Z" level=info msg="loading plugin" id=io.containerd.grpc.v1.sandboxes type=io.containerd.grpc.v1 Mar 21 12:12:02.632967 containerd[1400]: time="2025-03-21T12:12:02.632963640Z" level=info msg="loading plugin" id=io.containerd.grpc.v1.snapshots type=io.containerd.grpc.v1 Mar 21 12:12:02.633005 containerd[1400]: time="2025-03-21T12:12:02.632980160Z" level=info msg="loading plugin" id=io.containerd.streaming.v1.manager type=io.containerd.streaming.v1 Mar 21 12:12:02.633005 containerd[1400]: time="2025-03-21T12:12:02.632992200Z" level=info msg="loading plugin" id=io.containerd.grpc.v1.streaming type=io.containerd.grpc.v1 Mar 21 12:12:02.633047 containerd[1400]: time="2025-03-21T12:12:02.633004720Z" level=info msg="loading plugin" id=io.containerd.grpc.v1.tasks type=io.containerd.grpc.v1 Mar 21 12:12:02.633047 containerd[1400]: time="2025-03-21T12:12:02.633016480Z" level=info msg="loading plugin" id=io.containerd.transfer.v1.local type=io.containerd.transfer.v1 Mar 21 12:12:02.633047 containerd[1400]: time="2025-03-21T12:12:02.633043800Z" level=info msg="loading plugin" id=io.containerd.grpc.v1.transfer type=io.containerd.grpc.v1 Mar 21 12:12:02.633101 containerd[1400]: time="2025-03-21T12:12:02.633056440Z" level=info msg="loading plugin" id=io.containerd.grpc.v1.version type=io.containerd.grpc.v1 Mar 21 12:12:02.633101 containerd[1400]: time="2025-03-21T12:12:02.633066000Z" level=info msg="loading plugin" id=io.containerd.monitor.container.v1.restart type=io.containerd.monitor.container.v1 Mar 21 12:12:02.633101 containerd[1400]: time="2025-03-21T12:12:02.633096080Z" level=info msg="loading plugin" id=io.containerd.tracing.processor.v1.otlp type=io.containerd.tracing.processor.v1 Mar 21 12:12:02.633156 containerd[1400]: time="2025-03-21T12:12:02.633108680Z" level=info msg="skip loading plugin" error="skip plugin: tracing endpoint not configured" id=io.containerd.tracing.processor.v1.otlp type=io.containerd.tracing.processor.v1 Mar 21 12:12:02.633156 containerd[1400]: time="2025-03-21T12:12:02.633117320Z" level=info msg="loading plugin" id=io.containerd.internal.v1.tracing type=io.containerd.internal.v1 Mar 21 12:12:02.633156 containerd[1400]: time="2025-03-21T12:12:02.633126320Z" level=info msg="skip loading plugin" error="skip plugin: tracing endpoint not configured" id=io.containerd.internal.v1.tracing type=io.containerd.internal.v1 Mar 21 12:12:02.633156 containerd[1400]: time="2025-03-21T12:12:02.633133960Z" level=info msg="loading plugin" id=io.containerd.ttrpc.v1.otelttrpc type=io.containerd.ttrpc.v1 Mar 21 12:12:02.633156 containerd[1400]: time="2025-03-21T12:12:02.633144400Z" level=info msg="loading plugin" id=io.containerd.grpc.v1.healthcheck type=io.containerd.grpc.v1 Mar 21 12:12:02.633156 containerd[1400]: time="2025-03-21T12:12:02.633155240Z" level=info msg="loading plugin" id=io.containerd.nri.v1.nri type=io.containerd.nri.v1 Mar 21 12:12:02.633255 containerd[1400]: time="2025-03-21T12:12:02.633232240Z" level=info msg="runtime interface created" Mar 21 12:12:02.633255 containerd[1400]: time="2025-03-21T12:12:02.633238320Z" level=info msg="created NRI interface" Mar 21 12:12:02.633255 containerd[1400]: time="2025-03-21T12:12:02.633247160Z" level=info msg="loading plugin" id=io.containerd.grpc.v1.cri type=io.containerd.grpc.v1 Mar 21 12:12:02.633302 containerd[1400]: time="2025-03-21T12:12:02.633258080Z" level=info msg="Connect containerd service" Mar 21 12:12:02.633302 containerd[1400]: time="2025-03-21T12:12:02.633284560Z" level=info msg="using experimental NRI integration - disable nri plugin to prevent this" Mar 21 12:12:02.633924 containerd[1400]: time="2025-03-21T12:12:02.633896160Z" 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" Mar 21 12:12:02.737117 containerd[1400]: time="2025-03-21T12:12:02.736991080Z" level=info msg="Start subscribing containerd event" Mar 21 12:12:02.737117 containerd[1400]: time="2025-03-21T12:12:02.737071960Z" level=info msg="Start recovering state" Mar 21 12:12:02.737235 containerd[1400]: time="2025-03-21T12:12:02.737162200Z" level=info msg="Start event monitor" Mar 21 12:12:02.737235 containerd[1400]: time="2025-03-21T12:12:02.737175120Z" level=info msg="Start cni network conf syncer for default" Mar 21 12:12:02.737235 containerd[1400]: time="2025-03-21T12:12:02.737183760Z" level=info msg="Start streaming server" Mar 21 12:12:02.737235 containerd[1400]: time="2025-03-21T12:12:02.737193000Z" level=info msg="Registered namespace \"k8s.io\" with NRI" Mar 21 12:12:02.737235 containerd[1400]: time="2025-03-21T12:12:02.737200560Z" level=info msg="runtime interface starting up..." Mar 21 12:12:02.737235 containerd[1400]: time="2025-03-21T12:12:02.737206480Z" level=info msg="starting plugins..." Mar 21 12:12:02.737235 containerd[1400]: time="2025-03-21T12:12:02.737220600Z" level=info msg="Synchronizing NRI (plugin) with current runtime state" Mar 21 12:12:02.737605 containerd[1400]: time="2025-03-21T12:12:02.737328960Z" level=info msg=serving... address=/run/containerd/containerd.sock.ttrpc Mar 21 12:12:02.737605 containerd[1400]: time="2025-03-21T12:12:02.737375880Z" level=info msg=serving... address=/run/containerd/containerd.sock Mar 21 12:12:02.737605 containerd[1400]: time="2025-03-21T12:12:02.737518520Z" level=info msg="containerd successfully booted in 0.122640s" Mar 21 12:12:02.737626 systemd[1]: Started containerd.service - containerd container runtime. Mar 21 12:12:03.081955 sshd_keygen[1385]: ssh-keygen: generating new host keys: RSA ECDSA ED25519 Mar 21 12:12:03.098829 systemd[1]: Finished sshd-keygen.service - Generate sshd host keys. Mar 21 12:12:03.102876 systemd[1]: Starting issuegen.service - Generate /run/issue... Mar 21 12:12:03.118394 systemd[1]: issuegen.service: Deactivated successfully. Mar 21 12:12:03.119777 systemd[1]: Finished issuegen.service - Generate /run/issue. Mar 21 12:12:03.122810 systemd[1]: Starting systemd-user-sessions.service - Permit User Sessions... Mar 21 12:12:03.146062 systemd[1]: Finished systemd-user-sessions.service - Permit User Sessions. Mar 21 12:12:03.148919 systemd[1]: Started getty@tty1.service - Getty on tty1. Mar 21 12:12:03.150882 systemd[1]: Started serial-getty@ttyAMA0.service - Serial Getty on ttyAMA0. Mar 21 12:12:03.152085 systemd[1]: Reached target getty.target - Login Prompts. Mar 21 12:12:03.931909 systemd-networkd[1328]: eth0: Gained IPv6LL Mar 21 12:12:03.933936 systemd[1]: Finished systemd-networkd-wait-online.service - Wait for Network to be Configured. Mar 21 12:12:03.936089 systemd[1]: Reached target network-online.target - Network is Online. Mar 21 12:12:03.939205 systemd[1]: Starting coreos-metadata.service - QEMU metadata agent... Mar 21 12:12:03.941179 systemd[1]: Starting nvidia.service - NVIDIA Configure Service... Mar 21 12:12:03.966311 systemd[1]: Finished nvidia.service - NVIDIA Configure Service. Mar 21 12:12:03.967645 systemd[1]: coreos-metadata.service: Deactivated successfully. Mar 21 12:12:03.967834 systemd[1]: Finished coreos-metadata.service - QEMU metadata agent. Mar 21 12:12:03.970131 systemd[1]: packet-phone-home.service - Report Success to Packet was skipped because no trigger condition checks were met. Mar 21 12:12:03.970291 systemd[1]: Reached target multi-user.target - Multi-User System. Mar 21 12:12:03.971886 systemd[1]: Startup finished in 647ms (kernel) + 3.812s (initrd) + 3.419s (userspace) = 7.879s. Mar 21 12:12:10.135103 systemd[1]: Created slice system-sshd.slice - Slice /system/sshd. Mar 21 12:12:10.136712 systemd[1]: Started sshd@0-10.0.0.4:22-10.0.0.1:39756.service - OpenSSH per-connection server daemon (10.0.0.1:39756). Mar 21 12:12:10.217582 sshd[1486]: Accepted publickey for core from 10.0.0.1 port 39756 ssh2: RSA SHA256:MdsOSlIGNpcftqwP7ll+xX3Rmkua/0DX/UznjsKKr2Y Mar 21 12:12:10.221998 sshd-session[1486]: pam_unix(sshd:session): session opened for user core(uid=500) by core(uid=0) Mar 21 12:12:10.232646 systemd[1]: Created slice user-500.slice - User Slice of UID 500. Mar 21 12:12:10.233587 systemd[1]: Starting user-runtime-dir@500.service - User Runtime Directory /run/user/500... Mar 21 12:12:10.238255 systemd-logind[1379]: New session 1 of user core. Mar 21 12:12:10.252542 systemd[1]: Finished user-runtime-dir@500.service - User Runtime Directory /run/user/500. Mar 21 12:12:10.254970 systemd[1]: Starting user@500.service - User Manager for UID 500... Mar 21 12:12:10.271081 (systemd)[1490]: pam_unix(systemd-user:session): session opened for user core(uid=500) by (uid=0) Mar 21 12:12:10.273539 systemd-logind[1379]: New session c1 of user core. Mar 21 12:12:10.384232 systemd[1490]: Queued start job for default target default.target. Mar 21 12:12:10.394685 systemd[1490]: Created slice app.slice - User Application Slice. Mar 21 12:12:10.394715 systemd[1490]: Reached target paths.target - Paths. Mar 21 12:12:10.394777 systemd[1490]: Reached target timers.target - Timers. Mar 21 12:12:10.396029 systemd[1490]: Starting dbus.socket - D-Bus User Message Bus Socket... Mar 21 12:12:10.404838 systemd[1490]: Listening on dbus.socket - D-Bus User Message Bus Socket. Mar 21 12:12:10.404902 systemd[1490]: Reached target sockets.target - Sockets. Mar 21 12:12:10.404938 systemd[1490]: Reached target basic.target - Basic System. Mar 21 12:12:10.404967 systemd[1490]: Reached target default.target - Main User Target. Mar 21 12:12:10.404993 systemd[1490]: Startup finished in 125ms. Mar 21 12:12:10.405209 systemd[1]: Started user@500.service - User Manager for UID 500. Mar 21 12:12:10.406585 systemd[1]: Started session-1.scope - Session 1 of User core. Mar 21 12:12:10.473408 systemd[1]: Started sshd@1-10.0.0.4:22-10.0.0.1:39760.service - OpenSSH per-connection server daemon (10.0.0.1:39760). Mar 21 12:12:10.533885 sshd[1501]: Accepted publickey for core from 10.0.0.1 port 39760 ssh2: RSA SHA256:MdsOSlIGNpcftqwP7ll+xX3Rmkua/0DX/UznjsKKr2Y Mar 21 12:12:10.535094 sshd-session[1501]: pam_unix(sshd:session): session opened for user core(uid=500) by core(uid=0) Mar 21 12:12:10.539407 systemd-logind[1379]: New session 2 of user core. Mar 21 12:12:10.546904 systemd[1]: Started session-2.scope - Session 2 of User core. Mar 21 12:12:10.596381 sshd[1503]: Connection closed by 10.0.0.1 port 39760 Mar 21 12:12:10.596691 sshd-session[1501]: pam_unix(sshd:session): session closed for user core Mar 21 12:12:10.608631 systemd[1]: sshd@1-10.0.0.4:22-10.0.0.1:39760.service: Deactivated successfully. Mar 21 12:12:10.610152 systemd[1]: session-2.scope: Deactivated successfully. Mar 21 12:12:10.611982 systemd-logind[1379]: Session 2 logged out. Waiting for processes to exit. Mar 21 12:12:10.613959 systemd[1]: Started sshd@2-10.0.0.4:22-10.0.0.1:39768.service - OpenSSH per-connection server daemon (10.0.0.1:39768). Mar 21 12:12:10.616072 systemd-logind[1379]: Removed session 2. Mar 21 12:12:10.667617 sshd[1508]: Accepted publickey for core from 10.0.0.1 port 39768 ssh2: RSA SHA256:MdsOSlIGNpcftqwP7ll+xX3Rmkua/0DX/UznjsKKr2Y Mar 21 12:12:10.668625 sshd-session[1508]: pam_unix(sshd:session): session opened for user core(uid=500) by core(uid=0) Mar 21 12:12:10.672781 systemd-logind[1379]: New session 3 of user core. Mar 21 12:12:10.681885 systemd[1]: Started session-3.scope - Session 3 of User core. Mar 21 12:12:10.728034 sshd[1511]: Connection closed by 10.0.0.1 port 39768 Mar 21 12:12:10.728342 sshd-session[1508]: pam_unix(sshd:session): session closed for user core Mar 21 12:12:10.743695 systemd[1]: sshd@2-10.0.0.4:22-10.0.0.1:39768.service: Deactivated successfully. Mar 21 12:12:10.745348 systemd[1]: session-3.scope: Deactivated successfully. Mar 21 12:12:10.747883 systemd-logind[1379]: Session 3 logged out. Waiting for processes to exit. Mar 21 12:12:10.748923 systemd[1]: Started sshd@3-10.0.0.4:22-10.0.0.1:39770.service - OpenSSH per-connection server daemon (10.0.0.1:39770). Mar 21 12:12:10.749659 systemd-logind[1379]: Removed session 3. Mar 21 12:12:10.798849 sshd[1516]: Accepted publickey for core from 10.0.0.1 port 39770 ssh2: RSA SHA256:MdsOSlIGNpcftqwP7ll+xX3Rmkua/0DX/UznjsKKr2Y Mar 21 12:12:10.799990 sshd-session[1516]: pam_unix(sshd:session): session opened for user core(uid=500) by core(uid=0) Mar 21 12:12:10.804075 systemd-logind[1379]: New session 4 of user core. Mar 21 12:12:10.813937 systemd[1]: Started session-4.scope - Session 4 of User core. Mar 21 12:12:10.863189 sshd[1519]: Connection closed by 10.0.0.1 port 39770 Mar 21 12:12:10.863634 sshd-session[1516]: pam_unix(sshd:session): session closed for user core Mar 21 12:12:10.882393 systemd[1]: sshd@3-10.0.0.4:22-10.0.0.1:39770.service: Deactivated successfully. Mar 21 12:12:10.883860 systemd[1]: session-4.scope: Deactivated successfully. Mar 21 12:12:10.885936 systemd-logind[1379]: Session 4 logged out. Waiting for processes to exit. Mar 21 12:12:10.887377 systemd[1]: Started sshd@4-10.0.0.4:22-10.0.0.1:39786.service - OpenSSH per-connection server daemon (10.0.0.1:39786). Mar 21 12:12:10.888648 systemd-logind[1379]: Removed session 4. Mar 21 12:12:10.946396 sshd[1524]: Accepted publickey for core from 10.0.0.1 port 39786 ssh2: RSA SHA256:MdsOSlIGNpcftqwP7ll+xX3Rmkua/0DX/UznjsKKr2Y Mar 21 12:12:10.947433 sshd-session[1524]: pam_unix(sshd:session): session opened for user core(uid=500) by core(uid=0) Mar 21 12:12:10.951919 systemd-logind[1379]: New session 5 of user core. Mar 21 12:12:10.965966 systemd[1]: Started session-5.scope - Session 5 of User core. Mar 21 12:12:11.132964 systemd[1]: Starting docker.service - Docker Application Container Engine... Mar 21 12:12:11.148030 (dockerd)[1537]: docker.service: Referenced but unset environment variable evaluates to an empty string: DOCKER_CGROUPS, DOCKER_OPTS, DOCKER_OPT_BIP, DOCKER_OPT_IPMASQ, DOCKER_OPT_MTU Mar 21 12:12:11.391830 dockerd[1537]: time="2025-03-21T12:12:11.391772909Z" level=info msg="Starting up" Mar 21 12:12:11.392558 dockerd[1537]: time="2025-03-21T12:12:11.392537204Z" level=info msg="OTEL tracing is not configured, using no-op tracer provider" Mar 21 12:12:11.435747 dockerd[1537]: time="2025-03-21T12:12:11.435690186Z" level=info msg="Loading containers: start." Mar 21 12:12:11.571766 kernel: Initializing XFRM netlink socket Mar 21 12:12:11.633394 systemd-networkd[1328]: docker0: Link UP Mar 21 12:12:11.698136 dockerd[1537]: time="2025-03-21T12:12:11.697824827Z" level=info msg="Loading containers: done." Mar 21 12:12:11.709937 systemd[1]: var-lib-docker-overlay2-opaque\x2dbug\x2dcheck3427641498-merged.mount: Deactivated successfully. Mar 21 12:12:11.711490 dockerd[1537]: time="2025-03-21T12:12:11.711438211Z" level=warning msg="Not using native diff for overlay2, this may cause degraded performance for building images: kernel has CONFIG_OVERLAY_FS_REDIRECT_DIR enabled" storage-driver=overlay2 Mar 21 12:12:11.711557 dockerd[1537]: time="2025-03-21T12:12:11.711520676Z" level=info msg="Docker daemon" commit=c710b88579fcb5e0d53f96dcae976d79323b9166 containerd-snapshotter=false storage-driver=overlay2 version=27.4.1 Mar 21 12:12:11.711721 dockerd[1537]: time="2025-03-21T12:12:11.711694947Z" level=info msg="Daemon has completed initialization" Mar 21 12:12:11.741061 dockerd[1537]: time="2025-03-21T12:12:11.740973276Z" level=info msg="API listen on /run/docker.sock" Mar 21 12:12:11.741132 systemd[1]: Started docker.service - Docker Application Container Engine. Mar 21 12:12:14.444376 systemd[1]: var-lib-docker-overlay2-6352af0e6923493c51ac777ed63e174613a5f561f3b41e5cb71d96d7b6512a91-merged.mount: Deactivated successfully. Mar 21 12:12:21.522315 systemd[1]: var-lib-docker-overlay2-70777bebf1d04ca0ff40682216b8300e36a0e61ddd572e0a5631a57586e7f5a2-merged.mount: Deactivated successfully. Mar 21 12:12:21.846226 systemd[1]: var-lib-docker-overlay2-23ac9e714c46f76704eb4272319510a50a043a9c19d37ac88b45659a40c2e86e\x2dinit-merged.mount: Deactivated successfully. Mar 21 12:12:21.891447 containerd[1400]: time="2025-03-21T12:12:21.891391679Z" level=info msg="connecting to shim f88ea43ad67a980510516683b815244a41839752a4838a3d9bd8b55f2c31a918" address="unix:///run/containerd/s/a9f256672c8d2b217412e03f89b912b136a145703d5bb161a8ff549036f29987" namespace=moby protocol=ttrpc version=3 Mar 21 12:12:21.915907 systemd[1]: Started docker-f88ea43ad67a980510516683b815244a41839752a4838a3d9bd8b55f2c31a918.scope - libcontainer container f88ea43ad67a980510516683b815244a41839752a4838a3d9bd8b55f2c31a918. Mar 21 12:12:21.932245 systemd-resolved[1262]: Failed to determine the local hostname and LLMNR/mDNS names, ignoring: No such device or address Mar 21 12:12:21.952960 sshd[1527]: Connection closed by 10.0.0.1 port 39786 Mar 21 12:12:21.953369 sshd-session[1524]: pam_unix(sshd:session): session closed for user core Mar 21 12:12:21.964183 systemd[1]: sshd@4-10.0.0.4:22-10.0.0.1:39786.service: Deactivated successfully. Mar 21 12:12:21.965584 systemd[1]: session-5.scope: Deactivated successfully. Mar 21 12:12:21.966811 systemd-logind[1379]: Session 5 logged out. Waiting for processes to exit. Mar 21 12:12:21.968559 systemd[1]: Started sshd@5-10.0.0.4:22-10.0.0.1:44698.service - OpenSSH per-connection server daemon (10.0.0.1:44698). Mar 21 12:12:21.969399 systemd-logind[1379]: Removed session 5. Mar 21 12:12:22.020264 sshd[1791]: Accepted publickey for core from 10.0.0.1 port 44698 ssh2: RSA SHA256:MdsOSlIGNpcftqwP7ll+xX3Rmkua/0DX/UznjsKKr2Y Mar 21 12:12:22.021574 sshd-session[1791]: pam_unix(sshd:session): session opened for user core(uid=500) by core(uid=0) Mar 21 12:12:22.029595 systemd-logind[1379]: New session 6 of user core. Mar 21 12:12:22.034902 systemd[1]: Started session-6.scope - Session 6 of User core. Mar 21 12:12:22.095045 sshd[1794]: Connection closed by 10.0.0.1 port 44698 Mar 21 12:12:22.095590 sshd-session[1791]: pam_unix(sshd:session): session closed for user core Mar 21 12:12:22.108495 systemd[1]: sshd@5-10.0.0.4:22-10.0.0.1:44698.service: Deactivated successfully. Mar 21 12:12:22.110016 systemd[1]: session-6.scope: Deactivated successfully. Mar 21 12:12:22.110699 systemd-logind[1379]: Session 6 logged out. Waiting for processes to exit. Mar 21 12:12:22.112650 systemd[1]: Started sshd@6-10.0.0.4:22-10.0.0.1:44710.service - OpenSSH per-connection server daemon (10.0.0.1:44710). Mar 21 12:12:22.113476 systemd-logind[1379]: Removed session 6. Mar 21 12:12:22.163322 sshd[1806]: Accepted publickey for core from 10.0.0.1 port 44710 ssh2: RSA SHA256:MdsOSlIGNpcftqwP7ll+xX3Rmkua/0DX/UznjsKKr2Y Mar 21 12:12:22.164629 sshd-session[1806]: pam_unix(sshd:session): session opened for user core(uid=500) by core(uid=0) Mar 21 12:12:22.169280 systemd-logind[1379]: New session 7 of user core. Mar 21 12:12:22.178905 systemd[1]: Started session-7.scope - Session 7 of User core. Mar 21 12:12:22.277305 sudo[1810]: core : PWD=/home/core ; USER=root ; COMMAND=/usr/sbin/cat /var/lib/docker/containers/f88ea43ad67a980510516683b815244a41839752a4838a3d9bd8b55f2c31a918/f88ea43ad67a980510516683b815244a41839752a4838a3d9bd8b55f2c31a918-json.log Mar 21 12:12:22.279405 sudo[1810]: pam_unix(sudo:session): session opened for user root(uid=0) by core(uid=500) Mar 21 12:12:22.282464 sudo[1810]: pam_unix(sudo:session): session closed for user root Mar 21 12:12:22.285931 sshd[1809]: Connection closed by 10.0.0.1 port 44710 Mar 21 12:12:22.285856 sshd-session[1806]: pam_unix(sshd:session): session closed for user core Mar 21 12:12:22.288957 systemd[1]: sshd@6-10.0.0.4:22-10.0.0.1:44710.service: Deactivated successfully. Mar 21 12:12:22.290492 systemd[1]: session-7.scope: Deactivated successfully. Mar 21 12:12:22.292274 systemd-logind[1379]: Session 7 logged out. Waiting for processes to exit. Mar 21 12:12:22.294601 systemd-logind[1379]: Removed session 7. Mar 21 12:12:24.294280 systemd[1]: Started sshd@7-10.0.0.4:22-10.0.0.1:37798.service - OpenSSH per-connection server daemon (10.0.0.1:37798). Mar 21 12:12:24.350705 sshd[1824]: Accepted publickey for core from 10.0.0.1 port 37798 ssh2: RSA SHA256:MdsOSlIGNpcftqwP7ll+xX3Rmkua/0DX/UznjsKKr2Y Mar 21 12:12:24.351964 sshd-session[1824]: pam_unix(sshd:session): session opened for user core(uid=500) by core(uid=0) Mar 21 12:12:24.355933 systemd-logind[1379]: New session 8 of user core. Mar 21 12:12:24.374912 systemd[1]: Started session-8.scope - Session 8 of User core. Mar 21 12:12:24.433563 sshd[1826]: Connection closed by 10.0.0.1 port 37798 Mar 21 12:12:24.433430 sshd-session[1824]: pam_unix(sshd:session): session closed for user core Mar 21 12:12:24.448834 systemd[1]: sshd@7-10.0.0.4:22-10.0.0.1:37798.service: Deactivated successfully. Mar 21 12:12:24.450263 systemd[1]: session-8.scope: Deactivated successfully. Mar 21 12:12:24.450935 systemd-logind[1379]: Session 8 logged out. Waiting for processes to exit. Mar 21 12:12:24.452776 systemd[1]: Started sshd@8-10.0.0.4:22-10.0.0.1:37808.service - OpenSSH per-connection server daemon (10.0.0.1:37808). Mar 21 12:12:24.453615 systemd-logind[1379]: Removed session 8. Mar 21 12:12:24.512439 sshd[1838]: Accepted publickey for core from 10.0.0.1 port 37808 ssh2: RSA SHA256:MdsOSlIGNpcftqwP7ll+xX3Rmkua/0DX/UznjsKKr2Y Mar 21 12:12:24.513628 sshd-session[1838]: pam_unix(sshd:session): session opened for user core(uid=500) by core(uid=0) Mar 21 12:12:24.517329 systemd-logind[1379]: New session 9 of user core. Mar 21 12:12:24.523880 systemd[1]: Started session-9.scope - Session 9 of User core. Mar 21 12:12:24.588273 sudo[1842]: core : PWD=/home/core ; USER=root ; COMMAND=/usr/sbin/cat /var/lib/docker/containers/f88ea43ad67a980510516683b815244a41839752a4838a3d9bd8b55f2c31a918/f88ea43ad67a980510516683b815244a41839752a4838a3d9bd8b55f2c31a918-json.log Mar 21 12:12:24.588820 sudo[1842]: pam_unix(sudo:session): session opened for user root(uid=0) by core(uid=500) Mar 21 12:12:24.591574 sudo[1842]: pam_unix(sudo:session): session closed for user root Mar 21 12:12:24.592536 sshd[1841]: Connection closed by 10.0.0.1 port 37808 Mar 21 12:12:24.592953 sshd-session[1838]: pam_unix(sshd:session): session closed for user core Mar 21 12:12:24.605584 systemd[1]: sshd@8-10.0.0.4:22-10.0.0.1:37808.service: Deactivated successfully. Mar 21 12:12:24.606913 systemd[1]: session-9.scope: Deactivated successfully. Mar 21 12:12:24.608067 systemd-logind[1379]: Session 9 logged out. Waiting for processes to exit. Mar 21 12:12:24.609147 systemd[1]: Started sshd@9-10.0.0.4:22-10.0.0.1:37816.service - OpenSSH per-connection server daemon (10.0.0.1:37816). Mar 21 12:12:24.609861 systemd-logind[1379]: Removed session 9. Mar 21 12:12:24.651191 sshd[1855]: Accepted publickey for core from 10.0.0.1 port 37816 ssh2: RSA SHA256:MdsOSlIGNpcftqwP7ll+xX3Rmkua/0DX/UznjsKKr2Y Mar 21 12:12:24.652278 sshd-session[1855]: pam_unix(sshd:session): session opened for user core(uid=500) by core(uid=0) Mar 21 12:12:24.656594 systemd-logind[1379]: New session 10 of user core. Mar 21 12:12:24.671954 systemd[1]: Started session-10.scope - Session 10 of User core. Mar 21 12:12:25.087380 sshd[1858]: Connection closed by 10.0.0.1 port 37816 Mar 21 12:12:25.087819 sshd-session[1855]: pam_unix(sshd:session): session closed for user core Mar 21 12:12:25.094897 systemd[1]: sshd@9-10.0.0.4:22-10.0.0.1:37816.service: Deactivated successfully. Mar 21 12:12:25.096413 systemd[1]: session-10.scope: Deactivated successfully. Mar 21 12:12:25.097773 systemd[1]: session-10.scope: Consumed 348ms CPU time, 86.2M memory peak. Mar 21 12:12:25.099904 systemd-logind[1379]: Session 10 logged out. Waiting for processes to exit. Mar 21 12:12:25.100499 systemd[1]: Started sshd@10-10.0.0.4:22-10.0.0.1:37820.service - OpenSSH per-connection server daemon (10.0.0.1:37820). Mar 21 12:12:25.101390 systemd-logind[1379]: Removed session 10. Mar 21 12:12:25.155454 sshd[1886]: Accepted publickey for core from 10.0.0.1 port 37820 ssh2: RSA SHA256:MdsOSlIGNpcftqwP7ll+xX3Rmkua/0DX/UznjsKKr2Y Mar 21 12:12:25.156571 sshd-session[1886]: pam_unix(sshd:session): session opened for user core(uid=500) by core(uid=0) Mar 21 12:12:25.160942 systemd-logind[1379]: New session 11 of user core. Mar 21 12:12:25.171877 systemd[1]: Started session-11.scope - Session 11 of User core. Mar 21 12:12:25.231952 sshd[1889]: Connection closed by 10.0.0.1 port 37820 Mar 21 12:12:25.232293 sshd-session[1886]: pam_unix(sshd:session): session closed for user core Mar 21 12:12:25.245403 systemd[1]: sshd@10-10.0.0.4:22-10.0.0.1:37820.service: Deactivated successfully. Mar 21 12:12:25.247133 systemd[1]: session-11.scope: Deactivated successfully. Mar 21 12:12:25.249944 systemd-logind[1379]: Session 11 logged out. Waiting for processes to exit. Mar 21 12:12:25.251117 systemd[1]: Started sshd@11-10.0.0.4:22-10.0.0.1:37826.service - OpenSSH per-connection server daemon (10.0.0.1:37826). Mar 21 12:12:25.251790 systemd-logind[1379]: Removed session 11. Mar 21 12:12:25.306949 sshd[1901]: Accepted publickey for core from 10.0.0.1 port 37826 ssh2: RSA SHA256:MdsOSlIGNpcftqwP7ll+xX3Rmkua/0DX/UznjsKKr2Y Mar 21 12:12:25.308136 sshd-session[1901]: pam_unix(sshd:session): session opened for user core(uid=500) by core(uid=0) Mar 21 12:12:25.312634 systemd-logind[1379]: New session 12 of user core. Mar 21 12:12:25.324943 systemd[1]: Started session-12.scope - Session 12 of User core. Mar 21 12:12:25.396630 sshd[1904]: Connection closed by 10.0.0.1 port 37826 Mar 21 12:12:25.396939 sshd-session[1901]: pam_unix(sshd:session): session closed for user core Mar 21 12:12:25.412447 systemd[1]: sshd@11-10.0.0.4:22-10.0.0.1:37826.service: Deactivated successfully. Mar 21 12:12:25.413962 systemd[1]: session-12.scope: Deactivated successfully. Mar 21 12:12:25.415886 systemd-logind[1379]: Session 12 logged out. Waiting for processes to exit. Mar 21 12:12:25.418053 systemd[1]: Started sshd@12-10.0.0.4:22-10.0.0.1:37842.service - OpenSSH per-connection server daemon (10.0.0.1:37842). Mar 21 12:12:25.419082 systemd-logind[1379]: Removed session 12. Mar 21 12:12:25.468692 sshd[1923]: Accepted publickey for core from 10.0.0.1 port 37842 ssh2: RSA SHA256:MdsOSlIGNpcftqwP7ll+xX3Rmkua/0DX/UznjsKKr2Y Mar 21 12:12:25.469140 sshd-session[1923]: pam_unix(sshd:session): session opened for user core(uid=500) by core(uid=0) Mar 21 12:12:25.472924 systemd-logind[1379]: New session 13 of user core. Mar 21 12:12:25.485875 systemd[1]: Started session-13.scope - Session 13 of User core. Mar 21 12:12:25.549156 sudo[1927]: core : PWD=/home/core ; USER=root ; COMMAND=/usr/sbin/cat /var/lib/docker/containers/f88ea43ad67a980510516683b815244a41839752a4838a3d9bd8b55f2c31a918/f88ea43ad67a980510516683b815244a41839752a4838a3d9bd8b55f2c31a918-json.log Mar 21 12:12:25.549421 sudo[1927]: pam_unix(sudo:session): session opened for user root(uid=0) by core(uid=500) Mar 21 12:12:25.552873 sudo[1927]: pam_unix(sudo:session): session closed for user root Mar 21 12:12:25.555270 sshd[1926]: Connection closed by 10.0.0.1 port 37842 Mar 21 12:12:25.554298 sshd-session[1923]: pam_unix(sshd:session): session closed for user core Mar 21 12:12:25.557265 systemd[1]: sshd@12-10.0.0.4:22-10.0.0.1:37842.service: Deactivated successfully. Mar 21 12:12:25.560392 systemd[1]: session-13.scope: Deactivated successfully. Mar 21 12:12:25.563649 systemd-logind[1379]: Session 13 logged out. Waiting for processes to exit. Mar 21 12:12:25.564575 systemd-logind[1379]: Removed session 13.