Sep 3 18:37:14.522287 kernel: Booting Linux on physical CPU 0x0000000000 [0x410fd490] Sep 3 18:37:14.522317 kernel: Linux version 6.12.105-flatcar (build@pony-truck.infra.kinvolk.io) (aarch64-cros-linux-gnu-gcc (Gentoo Hardened 15.3.0 p8) 15.3.0, GNU ld (Gentoo 2.46.0 p1) 2.46.0) #1 SMP PREEMPT Thu Sep 3 16:30:43 -00 2026 Sep 3 18:37:14.522326 kernel: KASLR enabled Sep 3 18:37:14.522331 kernel: earlycon: pl11 at MMIO 0x00000000effec000 (options '') Sep 3 18:37:14.522336 kernel: printk: legacy bootconsole [pl11] enabled Sep 3 18:37:14.522342 kernel: efi: EFI v2.7 by EDK II Sep 3 18:37:14.522349 kernel: efi: ACPI 2.0=0x3f979018 SMBIOS=0x3f8a0000 SMBIOS 3.0=0x3f880000 MEMATTR=0x3e89c018 RNG=0x3f979998 MEMRESERVE=0x3db7b718 Sep 3 18:37:14.522354 kernel: random: crng init done Sep 3 18:37:14.522377 kernel: secureboot: Secure boot disabled Sep 3 18:37:14.522382 kernel: ACPI: Early table checksum verification disabled Sep 3 18:37:14.522386 kernel: ACPI: RSDP 0x000000003F979018 000024 (v02 VRTUAL) Sep 3 18:37:14.522392 kernel: ACPI: XSDT 0x000000003F979F18 00006C (v01 VRTUAL MICROSFT 00000001 MSFT 00000001) Sep 3 18:37:14.522397 kernel: ACPI: FACP 0x000000003F979C18 000114 (v06 VRTUAL MICROSFT 00000001 MSFT 00000001) Sep 3 18:37:14.522402 kernel: ACPI: DSDT 0x000000003F95A018 01E046 (v02 MSFTVM DSDT01 00000001 INTL 20230628) Sep 3 18:37:14.522409 kernel: ACPI: DBG2 0x000000003F979B18 000072 (v00 VRTUAL MICROSFT 00000001 MSFT 00000001) Sep 3 18:37:14.522414 kernel: ACPI: GTDT 0x000000003F979D98 000060 (v02 VRTUAL MICROSFT 00000001 MSFT 00000001) Sep 3 18:37:14.522420 kernel: ACPI: OEM0 0x000000003F979098 000064 (v01 VRTUAL MICROSFT 00000001 MSFT 00000001) Sep 3 18:37:14.522426 kernel: ACPI: SPCR 0x000000003F979A98 000050 (v02 VRTUAL MICROSFT 00000001 MSFT 00000001) Sep 3 18:37:14.522430 kernel: ACPI: APIC 0x000000003F979818 0000FC (v04 VRTUAL MICROSFT 00000001 MSFT 00000001) Sep 3 18:37:14.522434 kernel: ACPI: SRAT 0x000000003F979198 000234 (v03 VRTUAL MICROSFT 00000001 MSFT 00000001) Sep 3 18:37:14.522441 kernel: ACPI: PPTT 0x000000003F979418 000120 (v01 VRTUAL MICROSFT 00000000 MSFT 00000000) Sep 3 18:37:14.522446 kernel: ACPI: BGRT 0x000000003F979E98 000038 (v01 VRTUAL MICROSFT 00000001 MSFT 00000001) Sep 3 18:37:14.522451 kernel: ACPI: SPCR: console: pl011,mmio32,0xeffec000,115200 Sep 3 18:37:14.522456 kernel: ACPI: Use ACPI SPCR as default console: Yes Sep 3 18:37:14.522461 kernel: ACPI: SRAT: Node 0 PXM 0 [mem 0x00000000-0x3fffffff] hotplug Sep 3 18:37:14.522465 kernel: ACPI: SRAT: Node 0 PXM 0 [mem 0x100000000-0x1bfffffff] hotplug Sep 3 18:37:14.522470 kernel: ACPI: SRAT: Node 0 PXM 0 [mem 0x1c0000000-0xfbfffffff] hotplug Sep 3 18:37:14.522475 kernel: ACPI: SRAT: Node 0 PXM 0 [mem 0x1000000000-0xffffffffff] hotplug Sep 3 18:37:14.522480 kernel: ACPI: SRAT: Node 0 PXM 0 [mem 0x10000000000-0x1ffffffffff] hotplug Sep 3 18:37:14.522486 kernel: ACPI: SRAT: Node 0 PXM 0 [mem 0x20000000000-0x3ffffffffff] hotplug Sep 3 18:37:14.522491 kernel: ACPI: SRAT: Node 0 PXM 0 [mem 0x40000000000-0x7ffffffffff] hotplug Sep 3 18:37:14.522497 kernel: ACPI: SRAT: Node 0 PXM 0 [mem 0x80000000000-0xfffffffffff] hotplug Sep 3 18:37:14.522502 kernel: ACPI: SRAT: Node 0 PXM 0 [mem 0x100000000000-0x1fffffffffff] hotplug Sep 3 18:37:14.522506 kernel: ACPI: SRAT: Node 0 PXM 0 [mem 0x200000000000-0x3fffffffffff] hotplug Sep 3 18:37:14.522511 kernel: ACPI: SRAT: Node 0 PXM 0 [mem 0x400000000000-0x7fffffffffff] hotplug Sep 3 18:37:14.522516 kernel: ACPI: SRAT: Node 0 PXM 0 [mem 0x800000000000-0xffffffffffff] hotplug Sep 3 18:37:14.522522 kernel: NUMA: Node 0 [mem 0x00000000-0x3fffffff] + [mem 0x100000000-0x1bfffffff] -> [mem 0x00000000-0x1bfffffff] Sep 3 18:37:14.522527 kernel: NODE_DATA(0) allocated [mem 0x1bf7ffa00-0x1bf806fff] Sep 3 18:37:14.522533 kernel: Zone ranges: Sep 3 18:37:14.522537 kernel: DMA [mem 0x0000000000000000-0x00000000ffffffff] Sep 3 18:37:14.522545 kernel: DMA32 empty Sep 3 18:37:14.522550 kernel: Normal [mem 0x0000000100000000-0x00000001bfffffff] Sep 3 18:37:14.522555 kernel: Device empty Sep 3 18:37:14.522559 kernel: Movable zone start for each node Sep 3 18:37:14.522564 kernel: Early memory node ranges Sep 3 18:37:14.522569 kernel: node 0: [mem 0x0000000000000000-0x00000000007fffff] Sep 3 18:37:14.522575 kernel: node 0: [mem 0x0000000000824000-0x000000003f38ffff] Sep 3 18:37:14.522581 kernel: node 0: [mem 0x000000003f390000-0x000000003f93ffff] Sep 3 18:37:14.522585 kernel: node 0: [mem 0x000000003f940000-0x000000003f9effff] Sep 3 18:37:14.522590 kernel: node 0: [mem 0x000000003f9f0000-0x000000003fdeffff] Sep 3 18:37:14.522594 kernel: node 0: [mem 0x000000003fdf0000-0x000000003fffffff] Sep 3 18:37:14.522599 kernel: node 0: [mem 0x0000000100000000-0x00000001bfffffff] Sep 3 18:37:14.522603 kernel: Initmem setup node 0 [mem 0x0000000000000000-0x00000001bfffffff] Sep 3 18:37:14.522609 kernel: On node 0, zone DMA: 36 pages in unavailable ranges Sep 3 18:37:14.522613 kernel: cma: Reserved 16 MiB at 0x000000003ca00000 on node -1 Sep 3 18:37:14.522618 kernel: psci: probing for conduit method from ACPI. Sep 3 18:37:14.522624 kernel: psci: PSCIv1.3 detected in firmware. Sep 3 18:37:14.522629 kernel: psci: Using standard PSCI v0.2 function IDs Sep 3 18:37:14.522635 kernel: psci: MIGRATE_INFO_TYPE not supported. Sep 3 18:37:14.522641 kernel: psci: SMC Calling Convention v1.4 Sep 3 18:37:14.522645 kernel: ACPI: NUMA: SRAT: PXM 0 -> MPIDR 0x0 -> Node 0 Sep 3 18:37:14.522651 kernel: ACPI: NUMA: SRAT: PXM 0 -> MPIDR 0x1 -> Node 0 Sep 3 18:37:14.522657 kernel: percpu: Embedded 34 pages/cpu s98904 r8192 d32168 u139264 Sep 3 18:37:14.522662 kernel: pcpu-alloc: s98904 r8192 d32168 u139264 alloc=34*4096 Sep 3 18:37:14.522669 kernel: pcpu-alloc: [0] 0 [0] 1 Sep 3 18:37:14.522673 kernel: Detected PIPT I-cache on CPU0 Sep 3 18:37:14.522678 kernel: CPU features: detected: Address authentication (architected QARMA5 algorithm) Sep 3 18:37:14.522683 kernel: CPU features: detected: GIC system register CPU interface Sep 3 18:37:14.522689 kernel: CPU features: detected: Spectre-v4 Sep 3 18:37:14.522693 kernel: CPU features: detected: Spectre-BHB Sep 3 18:37:14.522698 kernel: CPU features: kernel page table isolation forced ON by KASLR Sep 3 18:37:14.522702 kernel: CPU features: detected: Kernel page table isolation (KPTI) Sep 3 18:37:14.522707 kernel: CPU features: detected: ARM erratum 2067961 or 2054223 Sep 3 18:37:14.522711 kernel: CPU features: detected: Broken broadcast TLBI completion Sep 3 18:37:14.522716 kernel: CPU features: detected: SSBS not fully self-synchronizing Sep 3 18:37:14.522720 kernel: alternatives: applying boot alternatives Sep 3 18:37:14.522725 kernel: Kernel command line: BOOT_IMAGE=/flatcar/vmlinuz-a mount.usr=/dev/mapper/usr verity.usr=PARTUUID=7130c94a-213a-4e5a-8e26-6cce9662f132 rootflags=rw mount.usrflags=ro consoleblank=0 root=LABEL=ROOT console=tty1 console=ttyAMA0,115200n8 earlycon=pl011,0xeffec000 flatcar.first_boot=detected acpi=force flatcar.oem.id=azure flatcar.autologin verity.usrhash=b2b8159c78a359bab6e646f71670db7ac8b5057d64f64403b1a1bedeebc16aca Sep 3 18:37:14.522731 kernel: Dentry cache hash table entries: 524288 (order: 10, 4194304 bytes, linear) Sep 3 18:37:14.522736 kernel: Inode-cache hash table entries: 262144 (order: 9, 2097152 bytes, linear) Sep 3 18:37:14.522741 kernel: Fallback order for Node 0: 0 Sep 3 18:37:14.522746 kernel: Built 1 zonelists, mobility grouping on. Total pages: 1048540 Sep 3 18:37:14.522750 kernel: Policy zone: Normal Sep 3 18:37:14.522756 kernel: mem auto-init: stack:off, heap alloc:off, heap free:off Sep 3 18:37:14.522760 kernel: software IO TLB: area num 2. Sep 3 18:37:14.522765 kernel: software IO TLB: mapped [mem 0x0000000034ae0000-0x0000000038ae0000] (64MB) Sep 3 18:37:14.522771 kernel: SLUB: HWalign=64, Order=0-3, MinObjects=0, CPUs=2, Nodes=1 Sep 3 18:37:14.522777 kernel: ftrace: allocating 41356 entries in 162 pages Sep 3 18:37:14.522781 kernel: ftrace: allocated 162 pages with 3 groups Sep 3 18:37:14.522786 kernel: rcu: Preemptible hierarchical RCU implementation. Sep 3 18:37:14.522792 kernel: rcu: RCU event tracing is enabled. Sep 3 18:37:14.522796 kernel: rcu: RCU restricting CPUs from NR_CPUS=512 to nr_cpu_ids=2. Sep 3 18:37:14.522801 kernel: Trampoline variant of Tasks RCU enabled. Sep 3 18:37:14.522807 kernel: Rude variant of Tasks RCU enabled. Sep 3 18:37:14.522811 kernel: Tracing variant of Tasks RCU enabled. Sep 3 18:37:14.522816 kernel: rcu: RCU calculated value of scheduler-enlistment delay is 100 jiffies. Sep 3 18:37:14.522820 kernel: rcu: Adjusting geometry for rcu_fanout_leaf=16, nr_cpu_ids=2 Sep 3 18:37:14.522825 kernel: RCU Tasks: Setting shift to 1 and lim to 1 rcu_task_cb_adjust=1 rcu_task_cpu_ids=2. Sep 3 18:37:14.522829 kernel: RCU Tasks Rude: Setting shift to 1 and lim to 1 rcu_task_cb_adjust=1 rcu_task_cpu_ids=2. Sep 3 18:37:14.522834 kernel: RCU Tasks Trace: Setting shift to 1 and lim to 1 rcu_task_cb_adjust=1 rcu_task_cpu_ids=2. Sep 3 18:37:14.522839 kernel: NR_IRQS: 64, nr_irqs: 64, preallocated irqs: 0 Sep 3 18:37:14.522845 kernel: GICv3: 960 SPIs implemented Sep 3 18:37:14.522849 kernel: GICv3: 0 Extended SPIs implemented Sep 3 18:37:14.522855 kernel: Root IRQ handler: gic_handle_irq Sep 3 18:37:14.522860 kernel: GICv3: GICv3 features: 16 PPIs, RSS Sep 3 18:37:14.522864 kernel: GICv3: GICD_CTRL.DS=0, SCR_EL3.FIQ=0 Sep 3 18:37:14.522869 kernel: GICv3: CPU0: found redistributor 0 region 0:0x00000000effee000 Sep 3 18:37:14.522873 kernel: ITS: No ITS available, not enabling LPIs Sep 3 18:37:14.522877 kernel: rcu: srcu_init: Setting srcu_struct sizes based on contention. Sep 3 18:37:14.522883 kernel: clocksource: jiffies: mask: 0xffffffff max_cycles: 0xffffffff, max_idle_ns: 1911260446275000 ns Sep 3 18:37:14.522888 kernel: arch_timer: cp15 timer(s) running at 1000.00MHz (virt). Sep 3 18:37:14.522894 kernel: clocksource: arch_sys_counter: mask: 0x1fffffffffffffff max_cycles: 0x1cd42e4dffb, max_idle_ns: 881590591483 ns Sep 3 18:37:14.522898 kernel: sched_clock: 61 bits at 1000MHz, resolution 1ns, wraps every 4398046511103ns Sep 3 18:37:14.522903 kernel: Console: colour dummy device 80x25 Sep 3 18:37:14.522908 kernel: printk: legacy console [tty1] enabled Sep 3 18:37:14.522913 kernel: ACPI: Core revision 20240827 Sep 3 18:37:14.522918 kernel: Calibrating delay loop (skipped), value calculated using timer frequency.. 2000.00 BogoMIPS (lpj=1000000) Sep 3 18:37:14.522924 kernel: pid_max: default: 32768 minimum: 301 Sep 3 18:37:14.522929 kernel: LSM: initializing lsm=lockdown,capability,landlock,selinux,ima Sep 3 18:37:14.522937 kernel: landlock: Up and running. Sep 3 18:37:14.522944 kernel: SELinux: Initializing. Sep 3 18:37:14.522949 kernel: Mount-cache hash table entries: 8192 (order: 4, 65536 bytes, linear) Sep 3 18:37:14.522954 kernel: Mountpoint-cache hash table entries: 8192 (order: 4, 65536 bytes, linear) Sep 3 18:37:14.522959 kernel: Hyper-V: privilege flags low 0x2e7f, high 0x3b8030, hints 0xa0000e, misc 0x31e1 Sep 3 18:37:14.522964 kernel: Hyper-V: Host Build 10.0.26102.1405-1-0 Sep 3 18:37:14.522969 kernel: Hyper-V: enabling crash_kexec_post_notifiers Sep 3 18:37:14.522975 kernel: rcu: Hierarchical SRCU implementation. Sep 3 18:37:14.522980 kernel: rcu: Max phase no-delay instances is 400. Sep 3 18:37:14.522984 kernel: Timer migration: 1 hierarchy levels; 8 children per group; 1 crossnode level Sep 3 18:37:14.522989 kernel: Remapping and enabling EFI services. Sep 3 18:37:14.522994 kernel: smp: Bringing up secondary CPUs ... Sep 3 18:37:14.522999 kernel: Detected PIPT I-cache on CPU1 Sep 3 18:37:14.523004 kernel: GICv3: CPU1: found redistributor 1 region 1:0x00000000f000e000 Sep 3 18:37:14.523010 kernel: CPU1: Booted secondary processor 0x0000000001 [0x410fd490] Sep 3 18:37:14.523017 kernel: smp: Brought up 1 node, 2 CPUs Sep 3 18:37:14.523024 kernel: SMP: Total of 2 processors activated. Sep 3 18:37:14.523029 kernel: CPU: All CPU(s) started at EL1 Sep 3 18:37:14.523034 kernel: CPU features: detected: 32-bit EL0 Support Sep 3 18:37:14.523039 kernel: CPU features: detected: Instruction cache invalidation not required for I/D coherence Sep 3 18:37:14.523044 kernel: CPU features: detected: Data cache clean to the PoU not required for I/D coherence Sep 3 18:37:14.523049 kernel: CPU features: detected: Common not Private translations Sep 3 18:37:14.523054 kernel: CPU features: detected: CRC32 instructions Sep 3 18:37:14.523059 kernel: CPU features: detected: Generic authentication (architected QARMA5 algorithm) Sep 3 18:37:14.523064 kernel: CPU features: detected: RCpc load-acquire (LDAPR) Sep 3 18:37:14.523069 kernel: CPU features: detected: LSE atomic instructions Sep 3 18:37:14.523075 kernel: CPU features: detected: Privileged Access Never Sep 3 18:37:14.523080 kernel: CPU features: detected: Speculation barrier (SB) Sep 3 18:37:14.523089 kernel: CPU features: detected: TLB range maintenance instructions Sep 3 18:37:14.523094 kernel: CPU features: detected: Speculative Store Bypassing Safe (SSBS) Sep 3 18:37:14.523098 kernel: CPU features: detected: Scalable Vector Extension Sep 3 18:37:14.523103 kernel: alternatives: applying system-wide alternatives Sep 3 18:37:14.523108 kernel: CPU features: detected: Hardware dirty bit management on CPU0-1 Sep 3 18:37:14.523113 kernel: SVE: maximum available vector length 16 bytes per vector Sep 3 18:37:14.523118 kernel: SVE: default vector length 16 bytes per vector Sep 3 18:37:14.523124 kernel: Memory: 3976384K/4194160K available (12480K kernel code, 2480K rwdata, 9568K rodata, 13440K init, 1040K bss, 195832K reserved, 16384K cma-reserved) Sep 3 18:37:14.523129 kernel: devtmpfs: initialized Sep 3 18:37:14.523134 kernel: futex hash table entries: 512 (order: 3, 32768 bytes, linear) Sep 3 18:37:14.523139 kernel: 2G module region forced by RANDOMIZE_MODULE_REGION_FULL Sep 3 18:37:14.523144 kernel: 0 pages in range for non-PLT usage Sep 3 18:37:14.523149 kernel: 514480 pages in range for PLT usage Sep 3 18:37:14.523154 kernel: pinctrl core: initialized pinctrl subsystem Sep 3 18:37:14.523159 kernel: SMBIOS 3.1.0 present. Sep 3 18:37:14.523164 kernel: DMI: Microsoft Corporation Virtual Machine/Virtual Machine, BIOS Hyper-V UEFI Release v4.1 01/08/2026 Sep 3 18:37:14.523169 kernel: DMI: Memory slots populated: 2/2 Sep 3 18:37:14.523174 kernel: NET: Registered PF_NETLINK/PF_ROUTE protocol family Sep 3 18:37:14.523179 kernel: DMA: preallocated 512 KiB GFP_KERNEL pool for atomic allocations Sep 3 18:37:14.523184 kernel: DMA: preallocated 512 KiB GFP_KERNEL|GFP_DMA pool for atomic allocations Sep 3 18:37:14.523189 kernel: DMA: preallocated 512 KiB GFP_KERNEL|GFP_DMA32 pool for atomic allocations Sep 3 18:37:14.523195 kernel: audit: initializing netlink subsys (disabled) Sep 3 18:37:14.523200 kernel: audit: type=2000 audit(0.059:1): state=initialized audit_enabled=0 res=1 Sep 3 18:37:14.523205 kernel: thermal_sys: Registered thermal governor 'step_wise' Sep 3 18:37:14.523210 kernel: cpuidle: using governor menu Sep 3 18:37:14.523215 kernel: hw-breakpoint: found 6 breakpoint and 4 watchpoint registers. Sep 3 18:37:14.523220 kernel: ASID allocator initialised with 32768 entries Sep 3 18:37:14.523225 kernel: acpiphp: ACPI Hot Plug PCI Controller Driver version: 0.5 Sep 3 18:37:14.523230 kernel: Serial: AMBA PL011 UART driver Sep 3 18:37:14.523235 kernel: HugeTLB: registered 1.00 GiB page size, pre-allocated 0 pages Sep 3 18:37:14.523240 kernel: HugeTLB: 0 KiB vmemmap can be freed for a 1.00 GiB page Sep 3 18:37:14.523245 kernel: HugeTLB: registered 32.0 MiB page size, pre-allocated 0 pages Sep 3 18:37:14.523250 kernel: HugeTLB: 0 KiB vmemmap can be freed for a 32.0 MiB page Sep 3 18:37:14.523255 kernel: HugeTLB: registered 2.00 MiB page size, pre-allocated 0 pages Sep 3 18:37:14.523260 kernel: HugeTLB: 0 KiB vmemmap can be freed for a 2.00 MiB page Sep 3 18:37:14.523265 kernel: HugeTLB: registered 64.0 KiB page size, pre-allocated 0 pages Sep 3 18:37:14.523270 kernel: HugeTLB: 0 KiB vmemmap can be freed for a 64.0 KiB page Sep 3 18:37:14.523275 kernel: ACPI: Added _OSI(Module Device) Sep 3 18:37:14.523280 kernel: ACPI: Added _OSI(Processor Device) Sep 3 18:37:14.523285 kernel: ACPI: Added _OSI(Processor Aggregator Device) Sep 3 18:37:14.523289 kernel: ACPI: 1 ACPI AML tables successfully acquired and loaded Sep 3 18:37:14.523294 kernel: ACPI: Interpreter enabled Sep 3 18:37:14.523299 kernel: ACPI: Using GIC for interrupt routing Sep 3 18:37:14.523305 kernel: ARMH0011:00: ttyAMA0 at MMIO 0xeffec000 (irq = 12, base_baud = 0) is a SBSA Sep 3 18:37:14.523310 kernel: printk: legacy console [ttyAMA0] enabled Sep 3 18:37:14.523315 kernel: printk: legacy bootconsole [pl11] disabled Sep 3 18:37:14.523320 kernel: ARMH0011:01: ttyAMA1 at MMIO 0xeffeb000 (irq = 13, base_baud = 0) is a SBSA Sep 3 18:37:14.523325 kernel: ACPI: CPU0 has been hot-added Sep 3 18:37:14.523329 kernel: ACPI: CPU1 has been hot-added Sep 3 18:37:14.523334 kernel: iommu: Default domain type: Translated Sep 3 18:37:14.523340 kernel: iommu: DMA domain TLB invalidation policy: strict mode Sep 3 18:37:14.523345 kernel: efivars: Registered efivars operations Sep 3 18:37:14.523350 kernel: vgaarb: loaded Sep 3 18:37:14.523355 kernel: clocksource: Switched to clocksource arch_sys_counter Sep 3 18:37:14.523368 kernel: VFS: Disk quotas dquot_6.6.0 Sep 3 18:37:14.523373 kernel: VFS: Dquot-cache hash table entries: 512 (order 0, 4096 bytes) Sep 3 18:37:14.523378 kernel: pnp: PnP ACPI init Sep 3 18:37:14.523383 kernel: pnp: PnP ACPI: found 0 devices Sep 3 18:37:14.523388 kernel: NET: Registered PF_INET protocol family Sep 3 18:37:14.523393 kernel: IP idents hash table entries: 65536 (order: 7, 524288 bytes, linear) Sep 3 18:37:14.523398 kernel: tcp_listen_portaddr_hash hash table entries: 2048 (order: 3, 32768 bytes, linear) Sep 3 18:37:14.523403 kernel: Table-perturb hash table entries: 65536 (order: 6, 262144 bytes, linear) Sep 3 18:37:14.523408 kernel: TCP established hash table entries: 32768 (order: 6, 262144 bytes, linear) Sep 3 18:37:14.523413 kernel: TCP bind hash table entries: 32768 (order: 8, 1048576 bytes, linear) Sep 3 18:37:14.523419 kernel: TCP: Hash tables configured (established 32768 bind 32768) Sep 3 18:37:14.523424 kernel: UDP hash table entries: 2048 (order: 4, 65536 bytes, linear) Sep 3 18:37:14.523429 kernel: UDP-Lite hash table entries: 2048 (order: 4, 65536 bytes, linear) Sep 3 18:37:14.523433 kernel: NET: Registered PF_UNIX/PF_LOCAL protocol family Sep 3 18:37:14.523439 kernel: PCI: CLS 0 bytes, default 64 Sep 3 18:37:14.523443 kernel: kvm [1]: HYP mode not available Sep 3 18:37:14.523448 kernel: Initialise system trusted keyrings Sep 3 18:37:14.523454 kernel: workingset: timestamp_bits=39 max_order=20 bucket_order=0 Sep 3 18:37:14.523459 kernel: Key type asymmetric registered Sep 3 18:37:14.523464 kernel: Asymmetric key parser 'x509' registered Sep 3 18:37:14.523469 kernel: Block layer SCSI generic (bsg) driver version 0.4 loaded (major 249) Sep 3 18:37:14.523474 kernel: io scheduler mq-deadline registered Sep 3 18:37:14.523479 kernel: io scheduler kyber registered Sep 3 18:37:14.523483 kernel: io scheduler bfq registered Sep 3 18:37:14.523489 kernel: Serial: 8250/16550 driver, 4 ports, IRQ sharing enabled Sep 3 18:37:14.523494 kernel: ACPI: bus type drm_connector registered Sep 3 18:37:14.523499 kernel: thunder_xcv, ver 1.0 Sep 3 18:37:14.523504 kernel: thunder_bgx, ver 1.0 Sep 3 18:37:14.523508 kernel: nicpf, ver 1.0 Sep 3 18:37:14.523513 kernel: nicvf, ver 1.0 Sep 3 18:37:14.523698 kernel: rtc-efi rtc-efi.0: registered as rtc0 Sep 3 18:37:14.523785 kernel: rtc-efi rtc-efi.0: setting system clock to 2026-09-03T18:37:09 UTC (1788460629) Sep 3 18:37:14.523792 kernel: efifb: probing for efifb Sep 3 18:37:14.523797 kernel: efifb: framebuffer at 0x40000000, using 3072k, total 3072k Sep 3 18:37:14.523802 kernel: efifb: mode is 1024x768x32, linelength=4096, pages=1 Sep 3 18:37:14.523809 kernel: efifb: scrolling: redraw Sep 3 18:37:14.523814 kernel: efifb: Truecolor: size=8:8:8:8, shift=24:16:8:0 Sep 3 18:37:14.523819 kernel: Console: switching to colour frame buffer device 128x48 Sep 3 18:37:14.523825 kernel: fb0: EFI VGA frame buffer device Sep 3 18:37:14.523830 kernel: SMCCC: SOC_ID: ARCH_SOC_ID not implemented, skipping .... Sep 3 18:37:14.523835 kernel: hid: raw HID events driver (C) Jiri Kosina Sep 3 18:37:14.523840 kernel: hw perfevents: enabled with armv8_pmuv3_0 PMU driver, 7 (0,8000003f) counters available Sep 3 18:37:14.523845 kernel: watchdog: NMI not fully supported Sep 3 18:37:14.523849 kernel: watchdog: Hard watchdog permanently disabled Sep 3 18:37:14.523854 kernel: NET: Registered PF_INET6 protocol family Sep 3 18:37:14.523860 kernel: Segment Routing with IPv6 Sep 3 18:37:14.523865 kernel: In-situ OAM (IOAM) with IPv6 Sep 3 18:37:14.523870 kernel: NET: Registered PF_PACKET protocol family Sep 3 18:37:14.523875 kernel: Key type dns_resolver registered Sep 3 18:37:14.523880 kernel: registered taskstats version 1 Sep 3 18:37:14.523885 kernel: Loading compiled-in X.509 certificates Sep 3 18:37:14.523889 kernel: Loaded X.509 cert 'Kinvolk GmbH: Module signing key for 6.12.105-flatcar: c1ad96dd7432bef9283c539c8098224a0b38519c' Sep 3 18:37:14.523896 kernel: Demotion targets for Node 0: null Sep 3 18:37:14.523900 kernel: Key type .fscrypt registered Sep 3 18:37:14.523905 kernel: Key type fscrypt-provisioning registered Sep 3 18:37:14.523910 kernel: ima: No TPM chip found, activating TPM-bypass! Sep 3 18:37:14.523915 kernel: ima: Allocated hash algorithm: sha1 Sep 3 18:37:14.523920 kernel: ima: No architecture policies found Sep 3 18:37:14.523925 kernel: alg: No test for fips(ansi_cprng) (fips_ansi_cprng) Sep 3 18:37:14.523931 kernel: clk: Disabling unused clocks Sep 3 18:37:14.523936 kernel: PM: genpd: Disabling unused power domains Sep 3 18:37:14.523941 kernel: Freeing unused kernel memory: 13440K Sep 3 18:37:14.523946 kernel: Run /init as init process Sep 3 18:37:14.523950 kernel: with arguments: Sep 3 18:37:14.523955 kernel: /init Sep 3 18:37:14.523960 kernel: with environment: Sep 3 18:37:14.523965 kernel: HOME=/ Sep 3 18:37:14.523970 kernel: TERM=linux Sep 3 18:37:14.523976 kernel: hv_vmbus: hv_mmio=[mem 0x40000000-0xfed3ffff],[mem 0xfc0000000-0xfffffffff] fb=[mem 0x40000000-0x47ffffff] Sep 3 18:37:14.523980 kernel: hv_vmbus: Vmbus version:5.3 Sep 3 18:37:14.523985 kernel: hv_vmbus: registering driver hid_hyperv Sep 3 18:37:14.523990 kernel: SCSI subsystem initialized Sep 3 18:37:14.523995 kernel: input: Microsoft Vmbus HID-compliant Mouse as /devices/0006:045E:0621.0001/input/input0 Sep 3 18:37:14.524099 kernel: hid-hyperv 0006:045E:0621.0001: input: VIRTUAL HID v0.01 Mouse [Microsoft Vmbus HID-compliant Mouse] on Sep 3 18:37:14.524107 kernel: hv_vmbus: registering driver hyperv_keyboard Sep 3 18:37:14.524113 kernel: input: AT Translated Set 2 keyboard as /devices/LNXSYSTM:00/LNXSYBUS:00/ACPI0004:00/MSFT1000:00/d34b2567-b9b6-42b9-8778-0a4ec0b955bf/serio0/input/input1 Sep 3 18:37:14.524118 kernel: pps_core: LinuxPPS API ver. 1 registered Sep 3 18:37:14.524123 kernel: pps_core: Software ver. 5.3.6 - Copyright 2005-2007 Rodolfo Giometti Sep 3 18:37:14.524128 kernel: PTP clock support registered Sep 3 18:37:14.524133 kernel: hv_utils: Registering HyperV Utility Driver Sep 3 18:37:14.524138 kernel: hv_vmbus: registering driver hv_utils Sep 3 18:37:14.524143 kernel: hv_utils: Heartbeat IC version 3.0 Sep 3 18:37:14.524148 kernel: hv_utils: Shutdown IC version 3.2 Sep 3 18:37:14.524153 kernel: hv_utils: TimeSync IC version 4.0 Sep 3 18:37:14.524158 kernel: hv_vmbus: registering driver hv_storvsc Sep 3 18:37:14.524274 kernel: scsi host0: storvsc_host_t Sep 3 18:37:14.526099 kernel: scsi host1: storvsc_host_t Sep 3 18:37:14.526287 kernel: scsi 1:0:0:0: Direct-Access Msft Virtual Disk 1.0 PQ: 0 ANSI: 5 Sep 3 18:37:14.526426 kernel: scsi 1:0:0:2: CD-ROM Msft Virtual DVD-ROM 1.0 PQ: 0 ANSI: 5 Sep 3 18:37:14.526528 kernel: sd 1:0:0:0: [sda] 63737856 512-byte logical blocks: (32.6 GB/30.4 GiB) Sep 3 18:37:14.526628 kernel: sd 1:0:0:0: [sda] 4096-byte physical blocks Sep 3 18:37:14.526726 kernel: sd 1:0:0:0: [sda] Write Protect is off Sep 3 18:37:14.526832 kernel: sd 1:0:0:0: [sda] Mode Sense: 0f 00 10 00 Sep 3 18:37:14.526929 kernel: sd 1:0:0:0: [sda] Write cache: disabled, read cache: enabled, supports DPO and FUA Sep 3 18:37:14.526936 kernel: sda: sda1 sda2 sda3 sda4 sda6 sda7 sda9 Sep 3 18:37:14.527033 kernel: sd 1:0:0:0: [sda] Attached SCSI disk Sep 3 18:37:14.527132 kernel: sr 1:0:0:2: [sr0] scsi-1 drive Sep 3 18:37:14.527138 kernel: cdrom: Uniform CD-ROM driver Revision: 3.20 Sep 3 18:37:14.527236 kernel: sr 1:0:0:2: Attached scsi CD-ROM sr0 Sep 3 18:37:14.527242 kernel: device-mapper: core: CONFIG_IMA_DISABLE_HTABLE is disabled. Duplicate IMA measurements will not be recorded in the IMA log. Sep 3 18:37:14.527248 kernel: device-mapper: uevent: version 1.0.3 Sep 3 18:37:14.527253 kernel: device-mapper: ioctl: 4.48.0-ioctl (2023-03-01) initialised: dm-devel@lists.linux.dev Sep 3 18:37:14.527258 kernel: device-mapper: verity: sha256 using shash "sha256-ce" Sep 3 18:37:14.527263 kernel: raid6: neonx8 gen() 18553 MB/s Sep 3 18:37:14.527268 kernel: raid6: neonx4 gen() 18578 MB/s Sep 3 18:37:14.527274 kernel: raid6: neonx2 gen() 16993 MB/s Sep 3 18:37:14.527279 kernel: raid6: neonx1 gen() 15190 MB/s Sep 3 18:37:14.527284 kernel: raid6: int64x8 gen() 8922 MB/s Sep 3 18:37:14.527289 kernel: raid6: int64x4 gen() 10741 MB/s Sep 3 18:37:14.527294 kernel: raid6: int64x2 gen() 8841 MB/s Sep 3 18:37:14.527299 kernel: raid6: int64x1 gen() 7092 MB/s Sep 3 18:37:14.527304 kernel: raid6: using algorithm neonx4 gen() 18578 MB/s Sep 3 18:37:14.527310 kernel: raid6: .... xor() 15163 MB/s, rmw enabled Sep 3 18:37:14.527315 kernel: raid6: using neon recovery algorithm Sep 3 18:37:14.527320 kernel: xor: measuring software checksum speed Sep 3 18:37:14.527325 kernel: 8regs : 27382 MB/sec Sep 3 18:37:14.527330 kernel: 32regs : 29690 MB/sec Sep 3 18:37:14.527336 kernel: arm64_neon : 37000 MB/sec Sep 3 18:37:14.527341 kernel: xor: using function: arm64_neon (37000 MB/sec) Sep 3 18:37:14.527346 kernel: Btrfs loaded, zoned=no, fsverity=no Sep 3 18:37:14.527352 kernel: BTRFS: device fsid 91189048-66ef-4889-be4c-200d4c9a866d devid 1 transid 40 /dev/mapper/usr (254:0) scanned by mount (334) Sep 3 18:37:14.527357 kernel: BTRFS info (device dm-0): first mount of filesystem 91189048-66ef-4889-be4c-200d4c9a866d Sep 3 18:37:14.527370 kernel: BTRFS info (device dm-0): using crc32c (crc32c-generic) checksum algorithm Sep 3 18:37:14.527376 kernel: BTRFS info (device dm-0 state E): disabling log replay at mount time Sep 3 18:37:14.527381 kernel: BTRFS info (device dm-0 state E): enabling free space tree Sep 3 18:37:14.527386 kernel: loop: module loaded Sep 3 18:37:14.527391 kernel: loop0: detected capacity change from 0 to 100536 Sep 3 18:37:14.527397 kernel: squashfs: version 4.0 (2009/01/31) Phillip Lougher Sep 3 18:37:14.527404 systemd[1]: Successfully made /usr/ read-only. Sep 3 18:37:14.527411 systemd[1]: systemd 260.1 running in system mode (+PAM +AUDIT +SELINUX -APPARMOR +IMA +IPE +SMACK +SECCOMP -GCRYPT -GNUTLS +OPENSSL -ACL +BLKID +CURL +ELFUTILS -FIDO2 +IDN2 +KMOD +LIBCRYPTSETUP +LIBCRYPTSETUP_PLUGINS +LIBFDISK +PCRE2 -PWQUALITY -P11KIT -QRENCODE +TPM2 +BZIP2 +LZ4 +XZ +ZLIB +ZSTD -BPF_FRAMEWORK -BTF -XKBCOMMON +UTMP +LIBARCHIVE) Sep 3 18:37:14.527417 systemd[1]: Detected virtualization microsoft. Sep 3 18:37:14.527422 systemd[1]: Detected architecture arm64. Sep 3 18:37:14.527429 systemd[1]: Running in initrd. Sep 3 18:37:14.527434 systemd[1]: Initializing machine ID from random generator. Sep 3 18:37:14.527440 systemd[1]: No hostname configured, using default hostname. Sep 3 18:37:14.527445 systemd[1]: Hostname set to . Sep 3 18:37:14.527451 (gene[367]: '/usr/lib/systemd/system-generators/dracut-crypt-generator' failed with exit status 2. Sep 3 18:37:14.527457 systemd[1]: Queued start job for default target initrd.target. Sep 3 18:37:14.527463 systemd[1]: Started clevis-luks-askpass.path - Forward Password Requests to Clevis Directory Watch. Sep 3 18:37:14.527469 systemd[1]: Started systemd-ask-password-console.path - Dispatch Password Requests to Console Directory Watch. Sep 3 18:37:14.527475 systemd[1]: Expecting device dev-disk-by\x2dlabel-EFI\x2dSYSTEM.device - /dev/disk/by-label/EFI-SYSTEM... Sep 3 18:37:14.527481 systemd[1]: Expecting device dev-disk-by\x2dlabel-OEM.device - /dev/disk/by-label/OEM... Sep 3 18:37:14.527487 systemd[1]: Expecting device dev-disk-by\x2dlabel-ROOT.device - /dev/disk/by-label/ROOT... Sep 3 18:37:14.527493 systemd[1]: Expecting device dev-disk-by\x2dpartlabel-USR\x2dA.device - /dev/disk/by-partlabel/USR-A... Sep 3 18:37:14.527499 systemd[1]: Expecting device dev-mapper-usr.device - /dev/mapper/usr... Sep 3 18:37:14.527504 systemd[1]: Reached target cryptsetup-pre.target - Local Encrypted Volumes (Pre). Sep 3 18:37:14.527510 systemd[1]: Reached target cryptsetup.target - Local Encrypted Volumes. Sep 3 18:37:14.527515 systemd[1]: Reached target initrd-usr-fs.target - Initrd /usr File System. Sep 3 18:37:14.527521 systemd[1]: Reached target paths.target - Path Units. Sep 3 18:37:14.527526 systemd[1]: Reached target slices.target - Slice Units. Sep 3 18:37:14.527531 systemd[1]: Reached target swap.target - Swaps. Sep 3 18:37:14.527538 systemd[1]: Reached target timers.target - Timer Units. Sep 3 18:37:14.527548 systemd[1]: Listening on iscsid.socket - Open-iSCSI iscsid Socket. Sep 3 18:37:14.527554 systemd[1]: Listening on iscsiuio.socket - Open-iSCSI iscsiuio Socket. Sep 3 18:37:14.527560 systemd[1]: Listening on systemd-coredump.socket - Process Core Dump Socket. Sep 3 18:37:14.527566 systemd[1]: Listening on systemd-journald-audit.socket - Journal Audit Socket. Sep 3 18:37:14.527573 systemd[1]: Listening on systemd-journald-dev-log.socket - Journal Socket (/dev/log). Sep 3 18:37:14.527578 systemd[1]: Listening on systemd-journald.socket - Journal Sockets. Sep 3 18:37:14.527584 systemd[1]: Listening on systemd-networkd-resolve-hook.socket - Network Management Resolve Hook Socket. Sep 3 18:37:14.527590 systemd[1]: Listening on systemd-networkd.socket - Network Management Netlink Socket. Sep 3 18:37:14.527595 systemd[1]: Listening on systemd-udevd-control.socket - udev Control Socket. Sep 3 18:37:14.527601 systemd[1]: Listening on systemd-udevd-kernel.socket - udev Kernel Socket. Sep 3 18:37:14.527606 systemd[1]: Reached target sockets.target - Socket Units. Sep 3 18:37:14.527613 systemd[1]: afterburn-network-kargs.service - Afterburn Initrd Setup Network Kernel Arguments skipped, no trigger condition checks were met. Sep 3 18:37:14.527619 systemd[1]: Starting ignition-setup-pre.service - Ignition env setup... Sep 3 18:37:14.527625 systemd[1]: Starting kmod-static-nodes.service - Create List of Static Device Nodes... Sep 3 18:37:14.527630 systemd[1]: Finished network-cleanup.service - Network Cleanup. Sep 3 18:37:14.527636 systemd[1]: systemd-battery-check.service - Early Battery Level Check skipped, unmet condition check ConditionDirectoryNotEmpty=/sys/class/power_supply Sep 3 18:37:14.527642 systemd[1]: Starting systemd-journald.service - Journal Service... Sep 3 18:37:14.527649 systemd[1]: Starting systemd-modules-load.service - Load Kernel Modules... Sep 3 18:37:14.527674 systemd-journald[522]: Collecting audit messages is enabled. Sep 3 18:37:14.527689 systemd[1]: Starting systemd-network-generator.service - Generate Network Units from Kernel Command Line... Sep 3 18:37:14.527698 systemd-journald[522]: Journal started Sep 3 18:37:14.527711 systemd-journald[522]: Runtime Journal (/run/log/journal/d5684a4144c842e788173f16014db183) is 8M, max 78.3M, 70.3M free. Sep 3 18:37:14.516618 systemd-modules-load[527]: Using 2 probe threads Sep 3 18:37:14.539461 systemd[1]: Starting systemd-vconsole-setup.service - Virtual Console Setup... Sep 3 18:37:14.561386 systemd[1]: Started systemd-journald.service - Journal Service. Sep 3 18:37:14.564000 audit[1]: SERVICE_START pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=systemd-journald comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Sep 3 18:37:14.570420 systemd[1]: Finished ignition-setup-pre.service - Ignition env setup. Sep 3 18:37:14.586664 kernel: audit: type=1130 audit(1788460634.564:2): pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=systemd-journald comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Sep 3 18:37:14.588086 systemd[1]: Finished kmod-static-nodes.service - Create List of Static Device Nodes. Sep 3 18:37:14.585000 audit[1]: SERVICE_START pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=ignition-setup-pre comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Sep 3 18:37:14.608000 audit[1]: SERVICE_START pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=kmod-static-nodes comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Sep 3 18:37:14.622379 kernel: audit: type=1130 audit(1788460634.585:3): pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=ignition-setup-pre comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Sep 3 18:37:14.622432 kernel: audit: type=1130 audit(1788460634.608:4): pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=kmod-static-nodes comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Sep 3 18:37:14.622440 kernel: bridge: filtering via arp/ip/ip6tables is no longer available by default. Update your scripts to load br_netfilter if you need this. Sep 3 18:37:14.629089 systemd[1]: Finished systemd-network-generator.service - Generate Network Units from Kernel Command Line. Sep 3 18:37:14.640000 audit[1]: SERVICE_START pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=systemd-network-generator comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Sep 3 18:37:14.653740 kernel: Bridge firewalling registered Sep 3 18:37:14.638196 systemd-modules-load[527]: Inserted module 'br_netfilter' Sep 3 18:37:14.657339 kernel: audit: type=1130 audit(1788460634.640:5): pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=systemd-network-generator comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Sep 3 18:37:14.673037 systemd[1]: Finished systemd-modules-load.service - Load Kernel Modules. Sep 3 18:37:14.679000 audit[1]: SERVICE_START pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=systemd-modules-load comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Sep 3 18:37:14.677747 systemd-vconsole-setup[532]: Configuration of first virtual console was skipped, ignoring remaining ones. Sep 3 18:37:14.700796 systemd[1]: Finished systemd-vconsole-setup.service - Virtual Console Setup. Sep 3 18:37:14.705000 audit[1]: SERVICE_START pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=systemd-vconsole-setup comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Sep 3 18:37:14.721866 kernel: audit: type=1130 audit(1788460634.679:6): pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=systemd-modules-load comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Sep 3 18:37:14.721885 kernel: audit: type=1130 audit(1788460634.705:7): pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=systemd-vconsole-setup comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Sep 3 18:37:14.724143 systemd[1]: Reached target network-pre.target - Preparation for Network. Sep 3 18:37:14.732543 systemd[1]: Starting dracut-cmdline-ask.service - dracut ask for additional cmdline parameters... Sep 3 18:37:14.746562 systemd[1]: Starting systemd-sysctl.service - Apply Kernel Variables... Sep 3 18:37:14.756925 systemd[1]: Starting systemd-tmpfiles-setup-dev-early.service - Create Static Device Nodes in /dev gracefully... Sep 3 18:37:14.770993 systemd[1]: Starting systemd-tmpfiles-setup.service - Create System Files and Directories... Sep 3 18:37:14.777276 systemd[1]: systemd-sysctl.service: Deactivated successfully. Sep 3 18:37:14.790000 audit[1]: SERVICE_START pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=systemd-sysctl comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Sep 3 18:37:14.782789 systemd[1]: Finished systemd-sysctl.service - Apply Kernel Variables. Sep 3 18:37:14.790000 audit[1]: SERVICE_STOP pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=systemd-sysctl comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Sep 3 18:37:14.823456 kernel: audit: type=1130 audit(1788460634.790:8): pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=systemd-sysctl comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Sep 3 18:37:14.823564 kernel: audit: type=1131 audit(1788460634.790:9): pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=systemd-sysctl comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Sep 3 18:37:14.820000 audit: BPF prog-id=5 op=LOAD Sep 3 18:37:14.825539 systemd[1]: Starting systemd-resolved.service - Network Name Resolution... Sep 3 18:37:14.831596 systemd-tmpfiles[566]: /usr/lib/tmpfiles.d/systemd.conf:30: Duplicate line for path "/var/lib/systemd", ignoring. Sep 3 18:37:14.847844 kernel: audit: type=1334 audit(1788460634.820:10): prog-id=5 op=LOAD Sep 3 18:37:14.831641 systemd-tmpfiles[566]: /usr/lib/tmpfiles.d/var.conf:14: Duplicate line for path "/var/log", ignoring. Sep 3 18:37:14.855600 systemd[1]: Finished systemd-tmpfiles-setup-dev-early.service - Create Static Device Nodes in /dev gracefully. Sep 3 18:37:14.861000 audit[1]: SERVICE_START pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=systemd-tmpfiles-setup-dev-early comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Sep 3 18:37:14.882392 kernel: audit: type=1130 audit(1788460634.861:11): pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=systemd-tmpfiles-setup-dev-early comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Sep 3 18:37:14.885453 systemd[1]: Finished systemd-tmpfiles-setup.service - Create System Files and Directories. Sep 3 18:37:14.889000 audit[1]: SERVICE_START pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=systemd-tmpfiles-setup comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Sep 3 18:37:14.898567 systemd[1]: Finished dracut-cmdline-ask.service - dracut ask for additional cmdline parameters. Sep 3 18:37:14.908000 audit[1]: SERVICE_START pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=dracut-cmdline-ask comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Sep 3 18:37:14.924532 systemd[1]: Starting dracut-cmdline.service - dracut cmdline hook... Sep 3 18:37:14.924790 systemd-resolved[573]: Positive Trust Anchors: Sep 3 18:37:14.924799 systemd-resolved[573]: . IN DS 20326 8 2 e06d44b80b8f1d39a95c0b0d7c65d08458e880409bbc683457104237c7f8ec8d Sep 3 18:37:14.924801 systemd-resolved[573]: . IN DS 38696 8 2 683d2d0acb8c9b712a1948b27f741219298d0a450d612c483af444a4c0fb2b16 Sep 3 18:37:14.924821 systemd-resolved[573]: Negative trust anchors: home.arpa 10.in-addr.arpa 16.172.in-addr.arpa 17.172.in-addr.arpa 18.172.in-addr.arpa 19.172.in-addr.arpa 20.172.in-addr.arpa 21.172.in-addr.arpa 22.172.in-addr.arpa 23.172.in-addr.arpa 24.172.in-addr.arpa 25.172.in-addr.arpa 26.172.in-addr.arpa 27.172.in-addr.arpa 28.172.in-addr.arpa 29.172.in-addr.arpa 30.172.in-addr.arpa 31.172.in-addr.arpa 170.0.0.192.in-addr.arpa 171.0.0.192.in-addr.arpa 168.192.in-addr.arpa d.f.ip6.arpa ipv4only.arpa resolver.arpa corp home internal intranet lan local private test Sep 3 18:37:14.953311 systemd-resolved[573]: Defaulting to hostname 'linux'. Sep 3 18:37:14.992883 dracut-cmdline[591]: dracut-111 Sep 3 18:37:14.996000 audit[1]: SERVICE_START pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=systemd-resolved comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Sep 3 18:37:14.979552 systemd[1]: Starting systemd-tmpfiles-setup-dev.service - Create Static Device Nodes in /dev... Sep 3 18:37:15.015354 dracut-cmdline[591]: Using kernel command line parameters: SYSTEMD_SULOGIN_FORCE=1 BOOT_IMAGE=/flatcar/vmlinuz-a mount.usr=/dev/mapper/usr verity.usr=PARTUUID=7130c94a-213a-4e5a-8e26-6cce9662f132 rootflags=rw mount.usrflags=ro consoleblank=0 root=LABEL=ROOT console=tty1 console=ttyAMA0,115200n8 earlycon=pl011,0xeffec000 flatcar.first_boot=detected acpi=force flatcar.oem.id=azure flatcar.autologin verity.usrhash=b2b8159c78a359bab6e646f71670db7ac8b5057d64f64403b1a1bedeebc16aca Sep 3 18:37:14.989633 systemd[1]: Started systemd-resolved.service - Network Name Resolution. Sep 3 18:37:15.050000 audit[1]: SERVICE_START pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=systemd-tmpfiles-setup-dev comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Sep 3 18:37:14.998418 systemd[1]: Reached target nss-lookup.target - Host and Network Name Lookups. Sep 3 18:37:15.040148 systemd[1]: Finished systemd-tmpfiles-setup-dev.service - Create Static Device Nodes in /dev. Sep 3 18:37:15.237395 kernel: Loading iSCSI transport class v2.0-870. Sep 3 18:37:15.285453 kernel: iscsi: registered transport (tcp) Sep 3 18:37:15.314569 kernel: iscsi: registered transport (qla4xxx) Sep 3 18:37:15.314602 kernel: QLogic iSCSI HBA Driver Sep 3 18:37:15.375775 systemd[1]: afterburn-network-kargs.service - Afterburn Initrd Setup Network Kernel Arguments skipped, no trigger condition checks were met. Sep 3 18:37:15.428415 systemd[1]: Finished dracut-cmdline.service - dracut cmdline hook. Sep 3 18:37:15.432000 audit[1]: SERVICE_START pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=dracut-cmdline comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Sep 3 18:37:15.435822 systemd[1]: Starting dracut-pre-udev.service - dracut pre-udev hook... Sep 3 18:37:15.474890 systemd[1]: Finished dracut-pre-udev.service - dracut pre-udev hook. Sep 3 18:37:15.482000 audit[1]: SERVICE_START pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=dracut-pre-udev comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Sep 3 18:37:15.483000 audit: BPF prog-id=6 op=LOAD Sep 3 18:37:15.483000 audit: BPF prog-id=7 op=LOAD Sep 3 18:37:15.485870 systemd[1]: Starting systemd-udevd.service - Rule-based Manager for Device Events and Files... Sep 3 18:37:15.579649 systemd-udevd[733]: Using default interface naming scheme 'v260'. Sep 3 18:37:15.592451 systemd[1]: Started systemd-udevd.service - Rule-based Manager for Device Events and Files. Sep 3 18:37:15.604000 audit[1]: SERVICE_START pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=systemd-udevd comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Sep 3 18:37:15.608283 systemd[1]: Starting dracut-pre-trigger.service - dracut pre-trigger hook... Sep 3 18:37:15.622000 audit: BPF prog-id=8 op=LOAD Sep 3 18:37:15.625488 systemd[1]: Starting systemd-networkd.service - Network Management... Sep 3 18:37:15.648878 dracut-pre-trigger[756]: rd.md=0: removing MD RAID activation Sep 3 18:37:15.663871 systemd-networkd[758]: Failed to open nftables netlink socket. IPMasquerade= and NFTSet= settings will not be applied. Ignoring: Protocol not supported Sep 3 18:37:15.677855 systemd-networkd[758]: lo: Link UP Sep 3 18:37:15.677861 systemd-networkd[758]: lo: Gained carrier Sep 3 18:37:15.684000 audit[1]: SERVICE_START pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=systemd-networkd comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Sep 3 18:37:15.679512 systemd[1]: Started systemd-networkd.service - Network Management. Sep 3 18:37:15.685876 systemd[1]: Reached target network.target - Network. Sep 3 18:37:15.710968 systemd[1]: Finished dracut-pre-trigger.service - dracut pre-trigger hook. Sep 3 18:37:15.714000 audit[1]: SERVICE_START pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=dracut-pre-trigger comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Sep 3 18:37:15.718679 systemd[1]: Starting systemd-udev-trigger.service - Coldplug All udev Devices... Sep 3 18:37:15.800625 systemd[1]: Finished systemd-udev-trigger.service - Coldplug All udev Devices. Sep 3 18:37:15.810000 audit[1]: SERVICE_START pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=systemd-udev-trigger comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Sep 3 18:37:15.812823 systemd[1]: Starting dracut-initqueue.service - dracut initqueue hook... Sep 3 18:37:15.897409 kernel: hv_storvsc f8b3781a-1e82-4818-a1c3-63d806ec15bb: tag#191 cmd 0x85 status: scsi 0x2 srb 0x6 hv 0xc0000001 Sep 3 18:37:15.967805 systemd[1]: systemd-vconsole-setup.service: Deactivated successfully. Sep 3 18:37:15.967948 systemd[1]: Stopped systemd-vconsole-setup.service - Virtual Console Setup. Sep 3 18:37:15.979000 audit[1]: SERVICE_STOP pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=systemd-vconsole-setup comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Sep 3 18:37:15.986851 kernel: hv_vmbus: registering driver hv_netvsc Sep 3 18:37:15.986931 systemd[1]: Stopping systemd-vconsole-setup.service - Virtual Console Setup... Sep 3 18:37:15.998886 systemd[1]: Starting systemd-vconsole-setup.service - Virtual Console Setup... Sep 3 18:37:16.022022 systemd-vconsole-setup[846]: Configuration of first virtual console was skipped, ignoring remaining ones. Sep 3 18:37:16.029239 systemd[1]: Finished systemd-vconsole-setup.service - Virtual Console Setup. Sep 3 18:37:16.033000 audit[1]: SERVICE_START pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=systemd-vconsole-setup comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Sep 3 18:37:16.078390 kernel: hv_netvsc 7ced8dc7-f8ba-7ced-8dc7-f8ba7ced8dc7 eth0: VF slot 1 added Sep 3 18:37:16.094293 systemd-networkd[758]: eth0: Configuring with /usr/lib/systemd/network/zz-default.network. Sep 3 18:37:16.101178 systemd-networkd[758]: eth0: Link UP Sep 3 18:37:16.101314 systemd-networkd[758]: eth0: Gained carrier Sep 3 18:37:16.115378 kernel: hv_vmbus: registering driver hv_pci Sep 3 18:37:16.123291 kernel: hv_pci 0dde362f-dffd-4a96-9024-0b48cc703192: PCI VMBus probing: Using version 0x10004 Sep 3 18:37:16.122435 systemd-networkd[758]: eth0: DHCPv4 address 10.0.0.4/24, gateway 10.0.0.1 acquired from 168.63.129.16 Sep 3 18:37:16.140433 kernel: hv_pci 0dde362f-dffd-4a96-9024-0b48cc703192: PCI host bridge to bus dffd:00 Sep 3 18:37:16.140811 kernel: pci_bus dffd:00: root bus resource [mem 0xfc0000000-0xfc00fffff window] Sep 3 18:37:16.140952 kernel: pci_bus dffd:00: No busn resource found for root bus, will use [bus 00-ff] Sep 3 18:37:16.152514 kernel: pci dffd:00:02.0: [15b3:101a] type 00 class 0x020000 PCIe Endpoint Sep 3 18:37:16.158409 kernel: pci dffd:00:02.0: BAR 0 [mem 0xfc0000000-0xfc00fffff 64bit pref] Sep 3 18:37:16.163393 kernel: pci dffd:00:02.0: enabling Extended Tags Sep 3 18:37:16.180415 kernel: pci dffd:00:02.0: 0.000 Gb/s available PCIe bandwidth, limited by Unknown x0 link at dffd:00:02.0 (capable of 252.048 Gb/s with 16.0 GT/s PCIe x16 link) Sep 3 18:37:16.190152 kernel: pci_bus dffd:00: busn_res: [bus 00-ff] end is updated to 00 Sep 3 18:37:16.190571 kernel: pci dffd:00:02.0: BAR 0 [mem 0xfc0000000-0xfc00fffff 64bit pref]: assigned Sep 3 18:37:16.221075 systemd[1]: Found device dev-disk-by\x2dpartlabel-USR\x2dA.device - Virtual_Disk USR-A. Sep 3 18:37:16.240831 systemd[1]: Starting disk-uuid.service - Generate new UUID for disk GPT if necessary... Sep 3 18:37:16.263693 systemd[1]: Found device dev-disk-by\x2dlabel-EFI\x2dSYSTEM.device - Virtual_Disk EFI-SYSTEM. Sep 3 18:37:16.303505 systemd[1]: Found device dev-disk-by\x2dlabel-OEM.device - Virtual_Disk OEM. Sep 3 18:37:16.329851 systemd[1]: Found device dev-disk-by\x2dlabel-ROOT.device - Virtual_Disk ROOT. Sep 3 18:37:16.386428 systemd[1]: Mounting oem.mount - /oem... Sep 3 18:37:16.446942 kernel: mlx5_core dffd:00:02.0: enabling device (0000 -> 0002) Sep 3 18:37:16.455111 kernel: mlx5_core dffd:00:02.0: PTM is not supported by PCIe Sep 3 18:37:16.455331 kernel: mlx5_core dffd:00:02.0: firmware version: 16.30.5026 Sep 3 18:37:16.487776 kernel: BTRFS: device label OEM devid 1 transid 11 /dev/sda6 (8:6) scanned by mount (910) Sep 3 18:37:16.487837 kernel: BTRFS info (device sda6): first mount of filesystem ddb4d8c9-86d1-4d4f-b3ae-7d49bfb534f6 Sep 3 18:37:16.493714 kernel: BTRFS info (device sda6): using crc32c (crc32c-generic) checksum algorithm Sep 3 18:37:16.547514 kernel: BTRFS info (device sda6): turning on async discard Sep 3 18:37:16.547582 kernel: BTRFS info (device sda6): enabling free space tree Sep 3 18:37:16.549806 systemd[1]: Mounted oem.mount - /oem. Sep 3 18:37:16.559582 systemd[1]: Starting ignition-fetch-offline.service - Ignition (fetch-offline)... Sep 3 18:37:16.642387 kernel: hv_netvsc 7ced8dc7-f8ba-7ced-8dc7-f8ba7ced8dc7 eth0: VF registering: eth1 Sep 3 18:37:16.646396 kernel: mlx5_core dffd:00:02.0 eth1: joined to eth0 Sep 3 18:37:16.653436 kernel: mlx5_core dffd:00:02.0: MLX5E: StrdRq(1) RqSz(8) StrdSz(2048) RxCqeCmprss(0 basic) Sep 3 18:37:16.663625 systemd-networkd[758]: eth1: Interface name change detected, renamed to enP57341s1. Sep 3 18:37:16.670127 kernel: mlx5_core dffd:00:02.0 enP57341s1: renamed from eth1 Sep 3 18:37:16.790417 kernel: mlx5_core dffd:00:02.0 enP57341s1: Link up Sep 3 18:37:16.826767 systemd-networkd[758]: enP57341s1: Link UP Sep 3 18:37:16.830204 kernel: hv_netvsc 7ced8dc7-f8ba-7ced-8dc7-f8ba7ced8dc7 eth0: Data path switched to VF: enP57341s1 Sep 3 18:37:17.106727 systemd-networkd[758]: enP57341s1: Gained carrier Sep 3 18:37:17.548840 disk-uuid[907]: Warning: The kernel is still using the old partition table. Sep 3 18:37:17.548840 disk-uuid[907]: The new table will be used at the next reboot or after you Sep 3 18:37:17.548840 disk-uuid[907]: run partprobe(8) or kpartx(8) Sep 3 18:37:17.548840 disk-uuid[907]: The operation has completed successfully. Sep 3 18:37:17.594113 ignition[932]: Ignition 2.27.0 Sep 3 18:37:17.594129 ignition[932]: Stage: fetch-offline Sep 3 18:37:17.604194 systemd[1]: Finished ignition-fetch-offline.service - Ignition (fetch-offline). Sep 3 18:37:17.594265 ignition[932]: no config dir at "/run/ignition/base.d" Sep 3 18:37:17.621000 audit[1]: SERVICE_START pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=ignition-fetch-offline comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Sep 3 18:37:17.626577 systemd[1]: Starting ignition-fetch.service - Ignition (fetch)... Sep 3 18:37:17.594339 ignition[932]: no config dir at "/etc/ignition/base.d" Sep 3 18:37:17.594442 ignition[932]: no config dir at "/usr/lib/ignition/base.d" Sep 3 18:37:17.594445 ignition[932]: no configs found in "base.d" across system config directories Sep 3 18:37:17.594451 ignition[932]: no config dir at "/run/ignition/base.platform.d/azure" Sep 3 18:37:17.594454 ignition[932]: no config dir at "/etc/ignition/base.platform.d/azure" Sep 3 18:37:17.594460 ignition[932]: no config dir at "/usr/lib/ignition/base.platform.d/azure" Sep 3 18:37:17.594462 ignition[932]: no configs found in "base.platform.d/azure" across system config directories Sep 3 18:37:17.594605 ignition[932]: reading system config file "/run/ignition/user.ign" Sep 3 18:37:17.686076 systemd-networkd[758]: eth0: Gained IPv6LL Sep 3 18:37:17.594610 ignition[932]: no config at "/run/ignition/user.ign" Sep 3 18:37:17.594612 ignition[932]: reading system config file "/etc/ignition/user.ign" Sep 3 18:37:17.594616 ignition[932]: no config at "/etc/ignition/user.ign" Sep 3 18:37:17.594618 ignition[932]: reading system config file "/usr/lib/ignition/user.ign" Sep 3 18:37:17.594636 ignition[932]: no config at "/usr/lib/ignition/user.ign" Sep 3 18:37:17.594640 ignition[932]: failed to fetch config: resource requires networking Sep 3 18:37:17.594785 ignition[932]: Ignition finished successfully Sep 3 18:37:17.656196 ignition[995]: Ignition 2.27.0 Sep 3 18:37:17.656202 ignition[995]: Stage: fetch Sep 3 18:37:17.656439 ignition[995]: no config dir at "/run/ignition/base.d" Sep 3 18:37:17.656445 ignition[995]: no config dir at "/etc/ignition/base.d" Sep 3 18:37:17.656458 ignition[995]: no config dir at "/usr/lib/ignition/base.d" Sep 3 18:37:17.656461 ignition[995]: no configs found in "base.d" across system config directories Sep 3 18:37:17.656466 ignition[995]: no config dir at "/run/ignition/base.platform.d/azure" Sep 3 18:37:17.656469 ignition[995]: no config dir at "/etc/ignition/base.platform.d/azure" Sep 3 18:37:17.656476 ignition[995]: no config dir at "/usr/lib/ignition/base.platform.d/azure" Sep 3 18:37:17.656478 ignition[995]: no configs found in "base.platform.d/azure" across system config directories Sep 3 18:37:17.656555 ignition[995]: reading system config file "/run/ignition/user.ign" Sep 3 18:37:17.656559 ignition[995]: no config at "/run/ignition/user.ign" Sep 3 18:37:17.656562 ignition[995]: reading system config file "/etc/ignition/user.ign" Sep 3 18:37:17.656564 ignition[995]: no config at "/etc/ignition/user.ign" Sep 3 18:37:17.656566 ignition[995]: reading system config file "/usr/lib/ignition/user.ign" Sep 3 18:37:17.656572 ignition[995]: no config at "/usr/lib/ignition/user.ign" Sep 3 18:37:17.656589 ignition[995]: GET http://169.254.169.254/metadata/instance/compute/userData?api-version=2021-01-01&format=text: attempt #1 Sep 3 18:37:17.726642 ignition[995]: GET result: OK Sep 3 18:37:17.726678 ignition[995]: failed to retrieve userdata from IMDS, falling back to custom data: not a config (empty) Sep 3 18:37:17.806953 ignition[995]: opening config device: "/dev/sr0" Sep 3 18:37:17.814683 ignition[995]: getting drive status for "/dev/sr0" Sep 3 18:37:17.816712 ignition[995]: drive status: OK Sep 3 18:37:17.816836 ignition[995]: mounting config device Sep 3 18:37:17.816842 ignition[995]: op(1): [started] mounting "/dev/sr0" at "/tmp/ignition-azure739374877" Sep 3 18:37:17.821885 systemd[1]: disk-uuid.service: Deactivated successfully. Sep 3 18:37:17.847961 systemd[1]: Finished disk-uuid.service - Generate new UUID for disk GPT if necessary. Sep 3 18:37:17.856000 audit[1]: SERVICE_START pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=disk-uuid comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Sep 3 18:37:17.856000 audit[1]: SERVICE_STOP pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=disk-uuid comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Sep 3 18:37:17.871436 kernel: UDF-fs: INFO Mounting volume 'UDF Volume', timestamp 2026/09/04 00:00 (1000) Sep 3 18:37:17.871542 ignition[995]: op(1): [finished] mounting "/dev/sr0" at "/tmp/ignition-azure739374877" Sep 3 18:37:17.871551 ignition[995]: checking for config drive Sep 3 18:37:17.876526 ignition[995]: reading config Sep 3 18:37:17.876755 systemd[1]: Mounting boot.mount - Boot partition... Sep 3 18:37:17.879874 ignition[995]: op(2): [started] unmounting "/dev/sr0" at "/tmp/ignition-azure739374877" Sep 3 18:37:17.880074 ignition[995]: op(2): [finished] unmounting "/dev/sr0" at "/tmp/ignition-azure739374877" Sep 3 18:37:17.882329 unknown[995]: fetched base config from "system" Sep 3 18:37:17.880102 ignition[995]: config has been read from custom data Sep 3 18:37:17.882342 unknown[995]: fetched base config from "system" Sep 3 18:37:17.904000 audit[1]: SERVICE_START pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=dracut-initqueue comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Sep 3 18:37:17.880121 ignition[995]: parsing config with SHA512: 33d0f56d0c9c2ad8621894f6dc682779204dbae50ec6fe3d368d7cc9692754b40ce6ea659182d720a5aa0c1f1c61496f85d226600ecff598f5af1aa20e1bd76a Sep 3 18:37:17.899518 systemd[1]: Finished dracut-initqueue.service - dracut initqueue hook. Sep 3 18:37:17.880216 ignition[995]: not a config (empty): provider config was empty, continuing with empty cache config Sep 3 18:37:17.917000 audit[1]: SERVICE_START pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=ignition-fetch comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Sep 3 18:37:17.913081 systemd[1]: Finished ignition-fetch.service - Ignition (fetch). Sep 3 18:37:17.882430 ignition[995]: fetch: fetch complete Sep 3 18:37:17.919733 systemd[1]: Reached target remote-fs-pre.target - Preparation for Remote File Systems. Sep 3 18:37:17.882432 ignition[995]: fetch: fetch passed Sep 3 18:37:17.926612 systemd[1]: Reached target remote-cryptsetup.target - Remote Encrypted Volumes. Sep 3 18:37:17.882478 ignition[995]: Ignition finished successfully Sep 3 18:37:17.945508 systemd[1]: Reached target remote-fs.target - Remote File Systems. Sep 3 18:37:17.955411 systemd[1]: Starting dracut-pre-mount.service - dracut pre-mount hook... Sep 3 18:37:17.967535 systemd[1]: Starting ignition-kargs.service - Ignition (kargs)... Sep 3 18:37:17.984707 systemd[1]: Mounted boot.mount - Boot partition. Sep 3 18:37:18.004050 ignition[1077]: Ignition 2.27.0 Sep 3 18:37:18.004056 ignition[1077]: Stage: kargs Sep 3 18:37:18.010000 audit[1]: SERVICE_START pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=dracut-pre-mount comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Sep 3 18:37:18.006045 systemd[1]: Finished dracut-pre-mount.service - dracut pre-mount hook. Sep 3 18:37:18.017000 audit[1]: SERVICE_START pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=ignition-kargs comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Sep 3 18:37:18.004312 ignition[1077]: no config dir at "/run/ignition/base.d" Sep 3 18:37:18.013316 systemd[1]: Finished ignition-kargs.service - Ignition (kargs). Sep 3 18:37:18.004317 ignition[1077]: no config dir at "/etc/ignition/base.d" Sep 3 18:37:18.021120 systemd[1]: Starting ignition-disks.service - Ignition (disks)... Sep 3 18:37:18.004330 ignition[1077]: no config dir at "/usr/lib/ignition/base.d" Sep 3 18:37:18.004332 ignition[1077]: no configs found in "base.d" across system config directories Sep 3 18:37:18.004338 ignition[1077]: no config dir at "/run/ignition/base.platform.d/azure" Sep 3 18:37:18.004341 ignition[1077]: no config dir at "/etc/ignition/base.platform.d/azure" Sep 3 18:37:18.004344 ignition[1077]: no config dir at "/usr/lib/ignition/base.platform.d/azure" Sep 3 18:37:18.004346 ignition[1077]: no configs found in "base.platform.d/azure" across system config directories Sep 3 18:37:18.004665 ignition[1077]: kargs: kargs passed Sep 3 18:37:18.004700 ignition[1077]: Ignition finished successfully Sep 3 18:37:18.081943 systemd[1]: ignition-kargs.service: Deactivated successfully. Sep 3 18:37:18.082054 systemd[1]: Stopped ignition-kargs.service - Ignition (kargs). Sep 3 18:37:18.089000 audit[1]: SERVICE_STOP pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=ignition-kargs comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Sep 3 18:37:18.096229 systemd[1]: ignition-fetch.service: Deactivated successfully. Sep 3 18:37:18.096390 systemd[1]: Stopped ignition-fetch.service - Ignition (fetch). Sep 3 18:37:18.103000 audit[1]: SERVICE_STOP pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=ignition-fetch comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Sep 3 18:37:18.105914 systemd[1]: ignition-fetch-offline.service: Deactivated successfully. Sep 3 18:37:18.111000 audit[1]: SERVICE_STOP pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=ignition-fetch-offline comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Sep 3 18:37:18.106103 systemd[1]: Stopped ignition-fetch-offline.service - Ignition (fetch-offline). Sep 3 18:37:18.116487 systemd[1]: Unmounting oem.mount - /oem... Sep 3 18:37:18.141371 kernel: BTRFS info (device sda6): last unmount of filesystem ddb4d8c9-86d1-4d4f-b3ae-7d49bfb534f6 Sep 3 18:37:18.142328 systemd[1]: oem.mount: Deactivated successfully. Sep 3 18:37:18.143346 systemd[1]: Unmounted oem.mount - /oem. Sep 3 18:37:18.170315 ignition[1110]: Ignition 2.27.0 Sep 3 18:37:18.170329 ignition[1110]: Stage: disks Sep 3 18:37:18.174966 systemd[1]: Finished ignition-disks.service - Ignition (disks). Sep 3 18:37:18.178000 audit[1]: SERVICE_START pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=ignition-disks comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Sep 3 18:37:18.170566 ignition[1110]: no config dir at "/run/ignition/base.d" Sep 3 18:37:18.179946 systemd[1]: Reached target initrd-root-device.target - Initrd Root Device. Sep 3 18:37:18.170571 ignition[1110]: no config dir at "/etc/ignition/base.d" Sep 3 18:37:18.187901 systemd[1]: Reached target local-fs-pre.target - Preparation for Local File Systems. Sep 3 18:37:18.170586 ignition[1110]: no config dir at "/usr/lib/ignition/base.d" Sep 3 18:37:18.195952 systemd[1]: Reached target local-fs.target - Local File Systems. Sep 3 18:37:18.170588 ignition[1110]: no configs found in "base.d" across system config directories Sep 3 18:37:18.204643 systemd[1]: Reached target sysinit.target - System Initialization. Sep 3 18:37:18.170593 ignition[1110]: no config dir at "/run/ignition/base.platform.d/azure" Sep 3 18:37:18.212104 systemd[1]: Reached target basic.target - Basic System. Sep 3 18:37:18.170596 ignition[1110]: no config dir at "/etc/ignition/base.platform.d/azure" Sep 3 18:37:18.222418 systemd[1]: Starting systemd-fsck-root.service - File System Check on /dev/disk/by-label/ROOT... Sep 3 18:37:18.170600 ignition[1110]: no config dir at "/usr/lib/ignition/base.platform.d/azure" Sep 3 18:37:18.170601 ignition[1110]: no configs found in "base.platform.d/azure" across system config directories Sep 3 18:37:18.170886 ignition[1110]: disks: disks passed Sep 3 18:37:18.170925 ignition[1110]: Ignition finished successfully Sep 3 18:37:18.428684 systemd-fsck[1121]: ROOT: clean, 15/6361680 files, 408771/6359552 blocks Sep 3 18:37:18.437123 systemd[1]: Finished systemd-fsck-root.service - File System Check on /dev/disk/by-label/ROOT. Sep 3 18:37:18.441000 audit[1]: SERVICE_START pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=systemd-fsck-root comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Sep 3 18:37:18.445545 systemd[1]: Mounting sysroot.mount - /sysroot... Sep 3 18:37:18.744387 kernel: EXT4-fs (sda9): mounted filesystem bb0230dc-ce06-4c9c-9fbf-63c80bc058ee r/w with ordered data mode. Quota mode: none. Sep 3 18:37:18.745255 systemd[1]: Mounted sysroot.mount - /sysroot. Sep 3 18:37:18.752783 systemd[1]: Reached target initrd-root-fs.target - Initrd Root File System. Sep 3 18:37:18.759385 systemd[1]: Starting flatcar-metadata-hostname.service - Flatcar Metadata Hostname Agent... Sep 3 18:37:18.768462 systemd[1]: ignition-remount-sysroot.service - Remount /sysroot read-write for Ignition skipped, unmet condition check ConditionPathIsReadWrite=!/sysroot Sep 3 18:37:18.768513 systemd[1]: Reached target ignition-diskful.target - Ignition Boot Disk Setup. Sep 3 18:37:18.903459 systemd[1]: Mounting sysroot-usr.mount - /sysroot/usr... Sep 3 18:37:18.921576 systemd[1]: Mounted sysroot-usr.mount - /sysroot/usr. Sep 3 18:37:18.927579 systemd[1]: Starting initrd-setup-root.service - Root filesystem setup... Sep 3 18:37:19.625768 coreos-metadata[1138]: Sep 03 18:37:19.625 INFO Fetching http://168.63.129.16/?comp=versions: Attempt #1 Sep 3 18:37:19.633092 coreos-metadata[1138]: Sep 03 18:37:19.632 INFO Fetch successful Sep 3 18:37:19.633092 coreos-metadata[1138]: Sep 03 18:37:19.633 INFO Fetching http://169.254.169.254/metadata/instance/compute/name?api-version=2017-08-01&format=text: Attempt #1 Sep 3 18:37:19.645732 coreos-metadata[1138]: Sep 03 18:37:19.645 INFO Fetch successful Sep 3 18:37:19.650677 coreos-metadata[1138]: Sep 03 18:37:19.645 INFO wrote hostname ci-9999.0.0-i-e5ff979d07 to /sysroot/etc/hostname Sep 3 18:37:19.656837 systemd[1]: Finished flatcar-metadata-hostname.service - Flatcar Metadata Hostname Agent. Sep 3 18:37:19.665000 audit[1]: SERVICE_START pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=flatcar-metadata-hostname comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Sep 3 18:37:19.670156 kernel: kauditd_printk_skb: 27 callbacks suppressed Sep 3 18:37:19.670174 kernel: audit: type=1130 audit(1788460639.665:39): pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=flatcar-metadata-hostname comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Sep 3 18:37:21.013605 kernel: loop1: detected capacity change from 0 to 44096 Sep 3 18:37:21.043389 kernel: loop1: p1 p2 p3 Sep 3 18:37:21.335907 kernel: device-mapper: verity: sha256 using shash "sha256-ce" Sep 3 18:37:21.335956 kernel: device-mapper: verity: Unrecognized verity feature request: root_hash_sig_key_desc Sep 3 18:37:21.340984 kernel: device-mapper: table: 254:1: verity: Unrecognized verity feature request (-EINVAL) Sep 3 18:37:21.344193 kernel: device-mapper: ioctl: error adding target to table Sep 3 18:37:21.344696 systemd-confext[1220]: device-mapper: reload ioctl on loop1p1-14-verity (254:1) failed: Invalid argument Sep 3 18:37:21.399540 kernel: device-mapper: verity: sha256 using shash "sha256-ce" Sep 3 18:37:21.535390 kernel: erofs: (device dm-1): mounted with root inode @ nid 40. Sep 3 18:37:21.556389 kernel: loop2: detected capacity change from 0 to 44096 Sep 3 18:37:21.684422 kernel: loop2: p1 p2 p3 Sep 3 18:37:21.697381 kernel: device-mapper: verity: sha256 using shash "sha256-ce" Sep 3 18:37:21.697437 kernel: device-mapper: verity: Unrecognized verity feature request: root_hash_sig_key_desc Sep 3 18:37:21.705781 kernel: device-mapper: table: 254:1: verity: Unrecognized verity feature request (-EINVAL) Sep 3 18:37:21.710319 kernel: device-mapper: ioctl: error adding target to table Sep 3 18:37:21.710396 (sd-merge)[1231]: device-mapper: reload ioctl on loop2p1-18-verity (254:1) failed: Invalid argument Sep 3 18:37:21.722380 kernel: device-mapper: verity: sha256 using shash "sha256-ce" Sep 3 18:37:21.738394 kernel: erofs: (device dm-1): mounted with root inode @ nid 40. Sep 3 18:37:21.738736 (sd-merge)[1231]: Using extensions '00-flatcar-default.raw'. Sep 3 18:37:21.739570 (sd-merge)[1231]: Merged extensions into '/sysroot/etc'. Sep 3 18:37:21.748099 initrd-setup-root[1238]: /etc 00-flatcar-default Thu 2026-09-03 18:37:14 UTC Sep 3 18:37:21.752741 systemd[1]: Finished initrd-setup-root.service - Root filesystem setup. Sep 3 18:37:21.761000 audit[1]: SERVICE_START pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=initrd-setup-root comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Sep 3 18:37:21.774509 kernel: audit: type=1130 audit(1788460641.761:40): pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=initrd-setup-root comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Sep 3 18:37:21.774684 systemd[1]: Starting ignition-mount.service - Ignition (mount)... Sep 3 18:37:21.816802 ignition[1244]: INFO : Ignition 2.27.0 Sep 3 18:37:21.816802 ignition[1244]: INFO : Stage: mount Sep 3 18:37:21.823478 ignition[1244]: INFO : no config dir at "/run/ignition/base.d" Sep 3 18:37:21.823478 ignition[1244]: INFO : no config dir at "/etc/ignition/base.d" Sep 3 18:37:21.823478 ignition[1244]: INFO : no config dir at "/usr/lib/ignition/base.d" Sep 3 18:37:21.823478 ignition[1244]: INFO : no configs found in "base.d" across system config directories Sep 3 18:37:21.823478 ignition[1244]: INFO : no config dir at "/run/ignition/base.platform.d/azure" Sep 3 18:37:21.823478 ignition[1244]: INFO : no config dir at "/etc/ignition/base.platform.d/azure" Sep 3 18:37:21.823478 ignition[1244]: INFO : no config dir at "/usr/lib/ignition/base.platform.d/azure" Sep 3 18:37:21.823478 ignition[1244]: INFO : no configs found in "base.platform.d/azure" across system config directories Sep 3 18:37:21.823478 ignition[1244]: INFO : mount: mount passed Sep 3 18:37:21.823478 ignition[1244]: INFO : Ignition finished successfully Sep 3 18:37:21.826000 audit[1]: SERVICE_START pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=ignition-mount comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Sep 3 18:37:21.821903 systemd[1]: Finished ignition-mount.service - Ignition (mount). Sep 3 18:37:21.913378 kernel: audit: type=1130 audit(1788460641.826:41): pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=ignition-mount comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Sep 3 18:37:21.829598 systemd[1]: Starting ignition-files.service - Ignition (files)... Sep 3 18:37:21.917436 kernel: BTRFS: device label OEM devid 1 transid 11 /dev/sda6 (8:6) scanned by mount (1255) Sep 3 18:37:21.860483 systemd[1]: Mounting oem.mount - /oem... Sep 3 18:37:21.920762 kernel: BTRFS info (device sda6): first mount of filesystem ddb4d8c9-86d1-4d4f-b3ae-7d49bfb534f6 Sep 3 18:37:21.920844 kernel: BTRFS info (device sda6): using crc32c (crc32c-generic) checksum algorithm Sep 3 18:37:22.037259 kernel: BTRFS info (device sda6): turning on async discard Sep 3 18:37:22.037316 kernel: BTRFS info (device sda6): enabling free space tree Sep 3 18:37:22.039697 systemd[1]: Mounted oem.mount - /oem. Sep 3 18:37:22.046456 systemd[1]: Mounting sysroot-oem.mount - /sysroot/oem... Sep 3 18:37:22.062324 systemd[1]: Mounted sysroot-oem.mount - /sysroot/oem. Sep 3 18:37:22.087285 ignition[1273]: INFO : Ignition 2.27.0 Sep 3 18:37:22.092195 ignition[1273]: INFO : Stage: files Sep 3 18:37:22.092195 ignition[1273]: INFO : no config dir at "/run/ignition/base.d" Sep 3 18:37:22.092195 ignition[1273]: INFO : no config dir at "/etc/ignition/base.d" Sep 3 18:37:22.092195 ignition[1273]: INFO : no config dir at "/usr/lib/ignition/base.d" Sep 3 18:37:22.092195 ignition[1273]: INFO : no configs found in "base.d" across system config directories Sep 3 18:37:22.092195 ignition[1273]: INFO : no config dir at "/run/ignition/base.platform.d/azure" Sep 3 18:37:22.092195 ignition[1273]: INFO : no config dir at "/etc/ignition/base.platform.d/azure" Sep 3 18:37:22.092195 ignition[1273]: INFO : no config dir at "/usr/lib/ignition/base.platform.d/azure" Sep 3 18:37:22.092195 ignition[1273]: INFO : no configs found in "base.platform.d/azure" across system config directories Sep 3 18:37:22.092195 ignition[1273]: DEBUG : files: compiled without relabeling support, skipping Sep 3 18:37:22.092195 ignition[1273]: INFO : files: createResultFile: createFiles: op(1): [started] writing file "/sysroot/etc/.ignition-result.json" Sep 3 18:37:22.092195 ignition[1273]: INFO : files: createResultFile: createFiles: op(1): [finished] writing file "/sysroot/etc/.ignition-result.json" Sep 3 18:37:22.092195 ignition[1273]: INFO : files: files passed Sep 3 18:37:22.092195 ignition[1273]: INFO : Ignition finished successfully Sep 3 18:37:22.098000 audit[1]: SERVICE_START pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=ignition-files comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Sep 3 18:37:22.172000 audit[1]: SERVICE_START pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=ignition-quench comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Sep 3 18:37:22.172000 audit[1]: SERVICE_STOP pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=ignition-quench comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Sep 3 18:37:22.219500 kernel: audit: type=1130 audit(1788460642.098:42): pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=ignition-files comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Sep 3 18:37:22.095230 systemd[1]: Finished ignition-files.service - Ignition (files). Sep 3 18:37:22.224828 kernel: audit: type=1130 audit(1788460642.172:43): pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=ignition-quench comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Sep 3 18:37:22.117570 systemd[1]: Starting ignition-quench.service - Ignition (record completion)... Sep 3 18:37:22.231568 kernel: audit: type=1131 audit(1788460642.172:44): pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=ignition-quench comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Sep 3 18:37:22.143879 systemd[1]: Starting initrd-setup-root-after-ignition.service - Root filesystem completion... Sep 3 18:37:22.150673 systemd[1]: ignition-quench.service: Deactivated successfully. Sep 3 18:37:22.161521 systemd[1]: Finished ignition-quench.service - Ignition (record completion). Sep 3 18:37:22.250647 initrd-setup-root-after-ignition[1308]: grep: /sysroot/etc/flatcar/enabled-sysext.conf: No such file or directory Sep 3 18:37:22.258604 initrd-setup-root-after-ignition[1304]: grep: /sysroot/etc/flatcar/enabled-sysext.conf: No such file or directory Sep 3 18:37:22.258604 initrd-setup-root-after-ignition[1304]: grep: /sysroot/usr/share/flatcar/enabled-sysext.conf: No such file or directory Sep 3 18:37:22.271252 kernel: loop3: detected capacity change from 0 to 44096 Sep 3 18:37:22.396697 kernel: loop3: p1 p2 p3 Sep 3 18:37:22.408113 kernel: device-mapper: verity: sha256 using shash "sha256-ce" Sep 3 18:37:22.408174 kernel: device-mapper: verity: Unrecognized verity feature request: root_hash_sig_key_desc Sep 3 18:37:22.413197 kernel: device-mapper: table: 254:2: verity: Unrecognized verity feature request (-EINVAL) Sep 3 18:37:22.417278 kernel: device-mapper: ioctl: error adding target to table Sep 3 18:37:22.417502 systemd-confext[1310]: device-mapper: reload ioctl on loop3p1-21-verity (254:2) failed: Invalid argument Sep 3 18:37:22.428945 kernel: device-mapper: verity: sha256 using shash "sha256-ce" Sep 3 18:37:22.446394 kernel: erofs: (device dm-2): mounted with root inode @ nid 40. Sep 3 18:37:22.469394 kernel: loop4: detected capacity change from 0 to 44096 Sep 3 18:37:22.682416 kernel: loop4: p1 p2 p3 Sep 3 18:37:22.696377 kernel: device-mapper: verity: sha256 using shash "sha256-ce" Sep 3 18:37:22.696429 kernel: device-mapper: verity: Unrecognized verity feature request: root_hash_sig_key_desc Sep 3 18:37:22.701388 kernel: device-mapper: table: 254:2: verity: Unrecognized verity feature request (-EINVAL) Sep 3 18:37:22.706854 kernel: device-mapper: ioctl: error adding target to table Sep 3 18:37:22.706941 (sd-merge)[1318]: device-mapper: reload ioctl on loop4p1-25-verity (254:2) failed: Invalid argument Sep 3 18:37:22.721163 kernel: device-mapper: verity: sha256 using shash "sha256-ce" Sep 3 18:37:22.740565 kernel: erofs: (device dm-2): mounted with root inode @ nid 40. Sep 3 18:37:22.740405 (sd-merge)[1318]: Skipping extension refresh because no change was found, use --always-refresh=yes to always do a refresh. Sep 3 18:37:22.796393 kernel: loop4: detected capacity change from 0 to 140928 Sep 3 18:37:22.811401 kernel: loop4: p1 p2 p3 Sep 3 18:37:23.434044 kernel: device-mapper: verity: sha256 using shash "sha256-ce" Sep 3 18:37:23.434120 kernel: device-mapper: verity: Unrecognized verity feature request: root_hash_sig_key_desc Sep 3 18:37:23.438701 kernel: device-mapper: table: 254:2: verity: Unrecognized verity feature request (-EINVAL) Sep 3 18:37:23.442171 kernel: device-mapper: ioctl: error adding target to table Sep 3 18:37:23.442429 systemd-sysext[1326]: device-mapper: reload ioctl on loop4p1-29-verity (254:2) failed: Invalid argument Sep 3 18:37:23.454384 kernel: device-mapper: verity: sha256 using shash "sha256-ce" Sep 3 18:37:24.144397 kernel: erofs: (device dm-2): mounted with root inode @ nid 39. Sep 3 18:37:24.358387 kernel: loop5: detected capacity change from 0 to 158496 Sep 3 18:37:24.449631 kernel: loop5: p1 p2 p3 Sep 3 18:37:25.157764 kernel: device-mapper: verity: sha256 using shash "sha256-ce" Sep 3 18:37:25.157824 kernel: device-mapper: verity: Unrecognized verity feature request: root_hash_sig_key_desc Sep 3 18:37:25.162812 kernel: device-mapper: table: 254:2: verity: Unrecognized verity feature request (-EINVAL) Sep 3 18:37:25.166149 kernel: device-mapper: ioctl: error adding target to table Sep 3 18:37:25.166380 systemd-sysext[1326]: device-mapper: reload ioctl on loop5p1-33-verity (254:2) failed: Invalid argument Sep 3 18:37:25.176483 kernel: device-mapper: verity: sha256 using shash "sha256-ce" Sep 3 18:37:25.501387 kernel: erofs: (device dm-2): mounted with root inode @ nid 39. Sep 3 18:37:25.607429 kernel: loop6: detected capacity change from 0 to 388472 Sep 3 18:37:25.845661 kernel: loop6: p1 p2 p3 Sep 3 18:37:26.491255 kernel: device-mapper: verity: sha256 using shash "sha256-ce" Sep 3 18:37:26.491315 kernel: device-mapper: verity: Unrecognized verity feature request: root_hash_sig_key_desc Sep 3 18:37:26.496386 kernel: device-mapper: table: 254:2: verity: Unrecognized verity feature request (-EINVAL) Sep 3 18:37:26.499838 kernel: device-mapper: ioctl: error adding target to table Sep 3 18:37:26.499990 systemd-sysext[1326]: device-mapper: reload ioctl on loop6p1-37-verity (254:2) failed: Invalid argument Sep 3 18:37:26.510637 kernel: device-mapper: verity: sha256 using shash "sha256-ce" Sep 3 18:37:27.166382 kernel: erofs: (device dm-2): mounted with root inode @ nid 39. Sep 3 18:37:27.358859 kernel: loop7: detected capacity change from 0 to 140928 Sep 3 18:37:27.358910 kernel: loop7: p1 p2 p3 Sep 3 18:37:27.511644 kernel: device-mapper: verity: sha256 using shash "sha256-ce" Sep 3 18:37:27.511703 kernel: device-mapper: verity: Unrecognized verity feature request: root_hash_sig_key_desc Sep 3 18:37:27.517813 kernel: device-mapper: table: 254:2: verity: Unrecognized verity feature request (-EINVAL) Sep 3 18:37:27.521201 kernel: device-mapper: ioctl: error adding target to table Sep 3 18:37:27.521271 (sd-merge)[1349]: device-mapper: reload ioctl on loop7p1-41-verity (254:2) failed: Invalid argument Sep 3 18:37:27.534374 kernel: device-mapper: verity: sha256 using shash "sha256-ce" Sep 3 18:37:27.561397 kernel: erofs: (device dm-2): mounted with root inode @ nid 39. Sep 3 18:37:27.565377 kernel: loop1: detected capacity change from 0 to 158496 Sep 3 18:37:27.568463 kernel: loop1: p1 p2 p3 Sep 3 18:37:27.579527 kernel: device-mapper: verity: sha256 using shash "sha256-ce" Sep 3 18:37:27.579577 kernel: device-mapper: verity: Unrecognized verity feature request: root_hash_sig_key_desc Sep 3 18:37:27.584409 kernel: device-mapper: table: 254:3: verity: Unrecognized verity feature request (-EINVAL) Sep 3 18:37:27.588137 kernel: device-mapper: ioctl: error adding target to table Sep 3 18:37:27.588307 (sd-merge)[1349]: device-mapper: reload ioctl on loop1p1-45-verity (254:3) failed: Invalid argument Sep 3 18:37:27.598218 kernel: device-mapper: verity: sha256 using shash "sha256-ce" Sep 3 18:37:27.763435 kernel: erofs: (device dm-3): mounted with root inode @ nid 39. Sep 3 18:37:27.768380 kernel: loop3: detected capacity change from 0 to 388472 Sep 3 18:37:27.771396 kernel: loop3: p1 p2 p3 Sep 3 18:37:27.803389 kernel: device-mapper: verity: sha256 using shash "sha256-ce" Sep 3 18:37:27.803482 kernel: device-mapper: verity: Unrecognized verity feature request: root_hash_sig_key_desc Sep 3 18:37:27.810521 kernel: device-mapper: table: 254:4: verity: Unrecognized verity feature request (-EINVAL) Sep 3 18:37:27.810570 kernel: device-mapper: ioctl: error adding target to table Sep 3 18:37:27.813531 (sd-merge)[1349]: device-mapper: reload ioctl on loop3p1-49-verity (254:4) failed: Invalid argument Sep 3 18:37:27.823910 kernel: device-mapper: verity: sha256 using shash "sha256-ce" Sep 3 18:37:27.851452 kernel: erofs: (device dm-4): mounted with root inode @ nid 39. Sep 3 18:37:27.852461 (sd-merge)[1349]: Using extensions 'containerd-flatcar.raw', 'docker-flatcar.raw', 'oem-azure-9999.0.0+ignition-2.27.raw'. Sep 3 18:37:27.853339 (sd-merge)[1349]: Merged extensions into '/sysroot/usr'. Sep 3 18:37:27.867438 systemd[1]: Finished initrd-setup-root-after-ignition.service - Root filesystem completion. Sep 3 18:37:27.872000 audit[1]: SERVICE_START pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=initrd-setup-root-after-ignition comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Sep 3 18:37:27.893478 kernel: audit: type=1130 audit(1788460647.872:45): pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=initrd-setup-root-after-ignition comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Sep 3 18:37:27.875243 systemd[1]: Starting initrd-parse-etc.service - Mountpoints Configured in the Real Root... Sep 3 18:37:27.924974 systemd[1]: initrd-parse-etc.service: Deactivated successfully. Sep 3 18:37:27.928393 systemd[1]: Finished initrd-parse-etc.service - Mountpoints Configured in the Real Root. Sep 3 18:37:27.933000 audit[1]: SERVICE_START pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=initrd-parse-etc comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Sep 3 18:37:27.934833 systemd[1]: initrd-parse-etc.service: Triggering OnSuccess= dependencies. Sep 3 18:37:27.933000 audit[1]: SERVICE_STOP pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=initrd-parse-etc comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Sep 3 18:37:27.971967 kernel: audit: type=1130 audit(1788460647.933:46): pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=initrd-parse-etc comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Sep 3 18:37:27.956989 systemd[1]: Reached target initrd-fs.target - Initrd File Systems. Sep 3 18:37:27.976200 kernel: audit: type=1131 audit(1788460647.933:47): pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=initrd-parse-etc comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Sep 3 18:37:27.977238 systemd[1]: Starting dracut-mount.service - dracut mount hook... Sep 3 18:37:28.820309 systemd[1]: Finished dracut-mount.service - dracut mount hook. Sep 3 18:37:28.823000 audit[1]: SERVICE_START pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=dracut-mount comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Sep 3 18:37:28.827524 systemd[1]: Starting dracut-pre-pivot.service - dracut pre-pivot and cleanup hook... Sep 3 18:37:28.849365 kernel: audit: type=1130 audit(1788460648.823:48): pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=dracut-mount comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Sep 3 18:37:28.863485 systemd[1]: Finished dracut-pre-pivot.service - dracut pre-pivot and cleanup hook. Sep 3 18:37:28.867000 audit[1]: SERVICE_START pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=dracut-pre-pivot comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Sep 3 18:37:28.886441 kernel: audit: type=1130 audit(1788460648.867:49): pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=dracut-pre-pivot comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Sep 3 18:37:28.886499 systemd[1]: Starting initrd-cleanup.service - Cleaning Up and Shutting Down Daemons... Sep 3 18:37:28.909047 systemd[1]: Stopped target basic.target - Basic System. Sep 3 18:37:28.913008 systemd[1]: Stopped target ignition-diskful.target - Ignition Boot Disk Setup. Sep 3 18:37:28.921770 systemd[1]: Stopped target initrd-root-device.target - Initrd Root Device. Sep 3 18:37:28.931111 systemd[1]: Stopped target initrd-usr-fs.target - Initrd /usr File System. Sep 3 18:37:28.940369 systemd[1]: Stopped target nss-lookup.target - Host and Network Name Lookups. Sep 3 18:37:28.949382 systemd[1]: Stopped target paths.target - Path Units. Sep 3 18:37:28.957428 systemd[1]: Stopped target remote-cryptsetup.target - Remote Encrypted Volumes. Sep 3 18:37:28.966046 systemd[1]: Stopped target slices.target - Slice Units. Sep 3 18:37:28.974216 systemd[1]: Stopped target sockets.target - Socket Units. Sep 3 18:37:28.982216 systemd[1]: Stopped target sysinit.target - System Initialization. Sep 3 18:37:28.989996 systemd[1]: Stopped target local-fs.target - Local File Systems. Sep 3 18:37:28.997995 systemd[1]: Stopped target local-fs-pre.target - Preparation for Local File Systems. Sep 3 18:37:29.007067 systemd[1]: Stopped target swap.target - Swaps. Sep 3 18:37:29.015510 systemd[1]: Stopped target timers.target - Timer Units. Sep 3 18:37:29.022319 systemd[1]: iscsid.socket: Deactivated successfully. Sep 3 18:37:29.022426 systemd[1]: Closed iscsid.socket - Open-iSCSI iscsid Socket. Sep 3 18:37:29.034045 systemd[1]: iscsiuio.socket: Deactivated successfully. Sep 3 18:37:29.034182 systemd[1]: Closed iscsiuio.socket - Open-iSCSI iscsiuio Socket. Sep 3 18:37:29.045493 systemd[1]: systemd-coredump.socket: Deactivated successfully. Sep 3 18:37:29.045629 systemd[1]: Closed systemd-coredump.socket - Process Core Dump Socket. Sep 3 18:37:29.054880 systemd[1]: systemd-journald-audit.socket: Deactivated successfully. Sep 3 18:37:29.054982 systemd[1]: Closed systemd-journald-audit.socket - Journal Audit Socket. Sep 3 18:37:29.076000 audit[1]: SERVICE_STOP pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=dracut-pre-pivot comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Sep 3 18:37:29.097685 kernel: audit: type=1131 audit(1788460649.076:50): pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=dracut-pre-pivot comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Sep 3 18:37:29.068017 systemd[1]: dracut-pre-pivot.service: Deactivated successfully. Sep 3 18:37:29.068150 systemd[1]: Stopped dracut-pre-pivot.service - dracut pre-pivot and cleanup hook. Sep 3 18:37:29.082356 systemd[1]: Stopped target remote-fs.target - Remote File Systems. Sep 3 18:37:29.114000 audit[1]: SERVICE_STOP pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=dracut-mount comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Sep 3 18:37:29.134282 kernel: audit: type=1131 audit(1788460649.114:51): pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=dracut-mount comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Sep 3 18:37:29.097836 systemd[1]: Stopped target remote-fs-pre.target - Preparation for Remote File Systems. Sep 3 18:37:29.133000 audit[1]: SERVICE_STOP pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=dracut-pre-mount comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Sep 3 18:37:29.106652 systemd[1]: dracut-mount.service: Deactivated successfully. Sep 3 18:37:29.106810 systemd[1]: Stopped dracut-mount.service - dracut mount hook. Sep 3 18:37:29.168023 kernel: audit: type=1131 audit(1788460649.133:52): pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=dracut-pre-mount comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Sep 3 18:37:29.118134 systemd[1]: dracut-pre-mount.service: Deactivated successfully. Sep 3 18:37:29.118304 systemd[1]: Stopped dracut-pre-mount.service - dracut pre-mount hook. Sep 3 18:37:29.136316 systemd[1]: Stopped target cryptsetup.target - Local Encrypted Volumes. Sep 3 18:37:29.158546 systemd[1]: systemd-ask-password-console.path: Deactivated successfully. Sep 3 18:37:29.194000 audit[1]: SERVICE_STOP pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=dracut-initqueue comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Sep 3 18:37:29.158906 systemd[1]: Stopped systemd-ask-password-console.path - Dispatch Password Requests to Console Directory Watch. Sep 3 18:37:29.168738 systemd[1]: Stopped target cryptsetup-pre.target - Local Encrypted Volumes (Pre). Sep 3 18:37:29.223000 audit[1]: SERVICE_STOP pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=initrd-setup-root-after-ignition comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Sep 3 18:37:29.240459 kernel: audit: type=1131 audit(1788460649.194:53): pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=dracut-initqueue comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Sep 3 18:37:29.177126 systemd[1]: clevis-luks-askpass.path: Deactivated successfully. Sep 3 18:37:29.244442 kernel: audit: type=1131 audit(1788460649.223:54): pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=initrd-setup-root-after-ignition comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Sep 3 18:37:29.177487 systemd[1]: Stopped clevis-luks-askpass.path - Forward Password Requests to Clevis Directory Watch. Sep 3 18:37:29.247000 audit[1]: SERVICE_STOP pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=ignition-files comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Sep 3 18:37:29.187206 systemd[1]: dracut-initqueue.service: Deactivated successfully. Sep 3 18:37:29.187392 systemd[1]: Stopped dracut-initqueue.service - dracut initqueue hook. Sep 3 18:37:29.263000 audit[1]: SERVICE_STOP pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=flatcar-metadata-hostname comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Sep 3 18:37:29.217410 systemd[1]: initrd-setup-root-after-ignition.service: Deactivated successfully. Sep 3 18:37:29.217570 systemd[1]: Stopped initrd-setup-root-after-ignition.service - Root filesystem completion. Sep 3 18:37:29.283000 audit[1]: SERVICE_STOP pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=systemd-modules-load comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Sep 3 18:37:29.241551 systemd[1]: ignition-files.service: Deactivated successfully. Sep 3 18:37:29.293000 audit[1]: SERVICE_STOP pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=systemd-tmpfiles-setup comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Sep 3 18:37:29.241702 systemd[1]: Stopped ignition-files.service - Ignition (files). Sep 3 18:37:29.255037 systemd[1]: flatcar-metadata-hostname.service: Deactivated successfully. Sep 3 18:37:29.313000 audit[1]: SERVICE_STOP pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=systemd-udev-trigger comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Sep 3 18:37:29.255237 systemd[1]: Stopped flatcar-metadata-hostname.service - Flatcar Metadata Hostname Agent. Sep 3 18:37:29.325500 ignition[1424]: INFO : Ignition 2.27.0 Sep 3 18:37:29.325500 ignition[1424]: INFO : Stage: umount Sep 3 18:37:29.325500 ignition[1424]: INFO : no config dir at "/run/ignition/base.d" Sep 3 18:37:29.325500 ignition[1424]: INFO : no config dir at "/etc/ignition/base.d" Sep 3 18:37:29.325500 ignition[1424]: INFO : no config dir at "/usr/lib/ignition/base.d" Sep 3 18:37:29.325500 ignition[1424]: INFO : no configs found in "base.d" across system config directories Sep 3 18:37:29.325500 ignition[1424]: INFO : no config dir at "/run/ignition/base.platform.d/azure" Sep 3 18:37:29.325500 ignition[1424]: INFO : no config dir at "/etc/ignition/base.platform.d/azure" Sep 3 18:37:29.325500 ignition[1424]: INFO : no config dir at "/usr/lib/ignition/base.platform.d/azure" Sep 3 18:37:29.325500 ignition[1424]: INFO : no configs found in "base.platform.d/azure" across system config directories Sep 3 18:37:29.325500 ignition[1424]: INFO : umount: umount passed Sep 3 18:37:29.325500 ignition[1424]: INFO : Ignition finished successfully Sep 3 18:37:29.324000 audit[1]: SERVICE_STOP pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=dracut-pre-trigger comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Sep 3 18:37:29.335000 audit[1]: SERVICE_STOP pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=ignition-mount comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Sep 3 18:37:29.351000 audit[1]: SERVICE_STOP pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=ignition-disks comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Sep 3 18:37:29.359000 audit[1]: SERVICE_STOP pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=ignition-setup-pre comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Sep 3 18:37:29.369000 audit[1]: SERVICE_STOP pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=initrd-setup-root comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Sep 3 18:37:29.399000 audit[1]: SERVICE_STOP pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=systemd-networkd comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Sep 3 18:37:29.267310 systemd[1]: Stopping ignition-mount.service - Ignition (mount)... Sep 3 18:37:29.274607 systemd[1]: systemd-modules-load.service: Deactivated successfully. Sep 3 18:37:29.420000 audit[1]: SERVICE_STOP pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=systemd-resolved comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Sep 3 18:37:29.277470 systemd[1]: Stopped systemd-modules-load.service - Load Kernel Modules. Sep 3 18:37:29.285872 systemd[1]: systemd-tmpfiles-setup.service: Deactivated successfully. Sep 3 18:37:29.434000 audit[1]: SERVICE_START pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=initrd-cleanup comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Sep 3 18:37:29.434000 audit[1]: SERVICE_STOP pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=initrd-cleanup comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Sep 3 18:37:29.436000 audit: BPF prog-id=5 op=UNLOAD Sep 3 18:37:29.286008 systemd[1]: Stopped systemd-tmpfiles-setup.service - Create System Files and Directories. Sep 3 18:37:29.303162 systemd[1]: systemd-udev-trigger.service: Deactivated successfully. Sep 3 18:37:29.303322 systemd[1]: Stopped systemd-udev-trigger.service - Coldplug All udev Devices. Sep 3 18:37:29.320657 systemd[1]: dracut-pre-trigger.service: Deactivated successfully. Sep 3 18:37:29.320819 systemd[1]: Stopped dracut-pre-trigger.service - dracut pre-trigger hook. Sep 3 18:37:29.328775 systemd[1]: ignition-mount.service: Deactivated successfully. Sep 3 18:37:29.331402 systemd[1]: Stopped ignition-mount.service - Ignition (mount). Sep 3 18:37:29.339295 systemd[1]: Stopped target network.target - Network. Sep 3 18:37:29.344317 systemd[1]: ignition-disks.service: Deactivated successfully. Sep 3 18:37:29.344404 systemd[1]: Stopped ignition-disks.service - Ignition (disks). Sep 3 18:37:29.353930 systemd[1]: ignition-setup-pre.service: Deactivated successfully. Sep 3 18:37:29.523000 audit[1]: SERVICE_STOP pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=systemd-udevd comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Sep 3 18:37:29.353987 systemd[1]: Stopped ignition-setup-pre.service - Ignition env setup. Sep 3 18:37:29.363123 systemd[1]: initrd-setup-root.service: Deactivated successfully. Sep 3 18:37:29.363188 systemd[1]: Stopped initrd-setup-root.service - Root filesystem setup. Sep 3 18:37:29.545000 audit[1]: SERVICE_STOP pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=dracut-pre-udev comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Sep 3 18:37:29.372260 systemd-networkd[758]: eth0: DHCP lease lost Sep 3 18:37:29.550000 audit: BPF prog-id=8 op=UNLOAD Sep 3 18:37:29.554000 audit[1]: SERVICE_STOP pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=dracut-cmdline comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Sep 3 18:37:29.372516 systemd[1]: Stopping systemd-networkd.service - Network Management... Sep 3 18:37:29.569000 audit[1]: SERVICE_STOP pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=dracut-cmdline-ask comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Sep 3 18:37:29.380061 systemd[1]: Stopping systemd-resolved.service - Network Name Resolution... Sep 3 18:37:29.390841 systemd[1]: systemd-networkd.service: Deactivated successfully. Sep 3 18:37:29.590000 audit[1]: SERVICE_STOP pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=systemd-network-generator comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Sep 3 18:37:29.596049 kernel: hv_netvsc 7ced8dc7-f8ba-7ced-8dc7-f8ba7ced8dc7 eth0: Data path switched from VF: enP57341s1 Sep 3 18:37:29.391930 systemd[1]: Stopped systemd-networkd.service - Network Management. Sep 3 18:37:29.600000 audit[1]: SERVICE_STOP pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=systemd-tmpfiles-setup-dev comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Sep 3 18:37:29.412504 systemd[1]: systemd-resolved.service: Deactivated successfully. Sep 3 18:37:29.615000 audit[1]: SERVICE_STOP pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=systemd-tmpfiles-setup-dev-early comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Sep 3 18:37:29.413469 systemd[1]: Stopped systemd-resolved.service - Network Name Resolution. Sep 3 18:37:29.624000 audit[1]: SERVICE_STOP pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=kmod-static-nodes comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Sep 3 18:37:29.428355 systemd[1]: initrd-cleanup.service: Deactivated successfully. Sep 3 18:37:29.429223 systemd[1]: Finished initrd-cleanup.service - Cleaning Up and Shutting Down Daemons. Sep 3 18:37:29.638000 audit[1]: SERVICE_STOP pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=systemd-vconsole-setup comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Sep 3 18:37:29.438454 systemd[1]: Stopped target network-pre.target - Preparation for Network. Sep 3 18:37:29.445916 systemd[1]: systemd-networkd-resolve-hook.socket: Deactivated successfully. Sep 3 18:37:29.653000 audit[1]: SERVICE_START pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=initrd-udevadm-cleanup-db comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Sep 3 18:37:29.653000 audit[1]: SERVICE_STOP pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=initrd-udevadm-cleanup-db comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Sep 3 18:37:29.446035 systemd[1]: Closed systemd-networkd-resolve-hook.socket - Network Management Resolve Hook Socket. Sep 3 18:37:29.662000 audit[1]: SERVICE_STOP pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=network-cleanup comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Sep 3 18:37:29.457746 systemd[1]: systemd-networkd.socket: Deactivated successfully. Sep 3 18:37:29.457819 systemd[1]: Closed systemd-networkd.socket - Network Management Netlink Socket. Sep 3 18:37:29.467664 systemd[1]: Stopping network-cleanup.service - Network Cleanup... Sep 3 18:37:29.476148 systemd[1]: Stopping systemd-udevd.service - Rule-based Manager for Device Events and Files... Sep 3 18:37:29.509755 systemd[1]: systemd-udevd.service: Deactivated successfully. Sep 3 18:37:29.517648 systemd[1]: Stopped systemd-udevd.service - Rule-based Manager for Device Events and Files. Sep 3 18:37:29.524488 systemd[1]: systemd-udevd.service: Consumed 1.177s CPU time over 14.023s wall clock time. Sep 3 18:37:29.526588 systemd[1]: systemd-udevd-control.socket: Deactivated successfully. Sep 3 18:37:29.526703 systemd[1]: Closed systemd-udevd-control.socket - udev Control Socket. Sep 3 18:37:29.535670 systemd[1]: dracut-pre-udev.service: Deactivated successfully. Sep 3 18:37:29.535727 systemd[1]: Stopped dracut-pre-udev.service - dracut pre-udev hook. Sep 3 18:37:29.548539 systemd[1]: dracut-cmdline.service: Deactivated successfully. Sep 3 18:37:29.548600 systemd[1]: Stopped dracut-cmdline.service - dracut cmdline hook. Sep 3 18:37:29.557747 systemd[1]: dracut-cmdline-ask.service: Deactivated successfully. Sep 3 18:37:29.557810 systemd[1]: Stopped dracut-cmdline-ask.service - dracut ask for additional cmdline parameters. Sep 3 18:37:29.576721 systemd[1]: Starting initrd-udevadm-cleanup-db.service - Cleanup udev Database... Sep 3 18:37:29.586752 systemd[1]: systemd-network-generator.service: Deactivated successfully. Sep 3 18:37:29.586814 systemd[1]: Stopped systemd-network-generator.service - Generate Network Units from Kernel Command Line. Sep 3 18:37:29.593590 systemd[1]: systemd-tmpfiles-setup-dev.service: Deactivated successfully. Sep 3 18:37:29.593646 systemd[1]: Stopped systemd-tmpfiles-setup-dev.service - Create Static Device Nodes in /dev. Sep 3 18:37:29.602698 systemd[1]: systemd-tmpfiles-setup-dev-early.service: Deactivated successfully. Sep 3 18:37:29.602750 systemd[1]: Stopped systemd-tmpfiles-setup-dev-early.service - Create Static Device Nodes in /dev gracefully. Sep 3 18:37:29.618163 systemd[1]: kmod-static-nodes.service: Deactivated successfully. Sep 3 18:37:29.618220 systemd[1]: Stopped kmod-static-nodes.service - Create List of Static Device Nodes. Sep 3 18:37:29.627300 systemd[1]: systemd-vconsole-setup.service: Deactivated successfully. Sep 3 18:37:29.627350 systemd[1]: Stopped systemd-vconsole-setup.service - Virtual Console Setup. Sep 3 18:37:29.645482 systemd[1]: initrd-udevadm-cleanup-db.service: Deactivated successfully. Sep 3 18:37:29.647166 systemd[1]: Finished initrd-udevadm-cleanup-db.service - Cleanup udev Database. Sep 3 18:37:29.656201 systemd[1]: network-cleanup.service: Deactivated successfully. Sep 3 18:37:29.658639 systemd[1]: Stopped network-cleanup.service - Network Cleanup. Sep 3 18:37:29.665390 systemd[1]: Reached target initrd-switch-root.target - Switch Root. Sep 3 18:37:29.674411 systemd[1]: Starting initrd-switch-root.service - Switch Root... Sep 3 18:37:29.705705 systemd[1]: Switching root. Sep 3 18:37:29.923055 systemd-journald[522]: Journal stopped Sep 3 18:37:38.515266 systemd-journald[522]: Received SIGTERM from PID 1 (systemd). Sep 3 18:37:38.515321 kernel: SELinux: policy capability network_peer_controls=1 Sep 3 18:37:38.515333 kernel: SELinux: policy capability open_perms=1 Sep 3 18:37:38.515343 kernel: SELinux: policy capability extended_socket_class=1 Sep 3 18:37:38.515351 kernel: SELinux: policy capability always_check_network=0 Sep 3 18:37:38.515371 kernel: SELinux: policy capability cgroup_seclabel=1 Sep 3 18:37:38.515381 kernel: SELinux: policy capability nnp_nosuid_transition=1 Sep 3 18:37:38.515390 kernel: SELinux: policy capability genfs_seclabel_symlinks=0 Sep 3 18:37:38.515398 kernel: SELinux: policy capability ioctl_skip_cloexec=0 Sep 3 18:37:38.515408 kernel: SELinux: policy capability userspace_initial_context=0 Sep 3 18:37:38.515415 systemd[1]: Successfully loaded SELinux policy in 359.991ms. Sep 3 18:37:38.515426 systemd[1]: Relabeled /dev/, /dev/shm/, /run/ in 5.969ms. Sep 3 18:37:38.515433 systemd[1]: systemd 260.1 running in system mode (+PAM +AUDIT +SELINUX -APPARMOR +IMA +IPE +SMACK +SECCOMP -GCRYPT -GNUTLS +OPENSSL -ACL +BLKID +CURL +ELFUTILS -FIDO2 +IDN2 +KMOD +LIBCRYPTSETUP +LIBCRYPTSETUP_PLUGINS +LIBFDISK +PCRE2 -PWQUALITY -P11KIT -QRENCODE +TPM2 +BZIP2 +LZ4 +XZ +ZLIB +ZSTD -BPF_FRAMEWORK -BTF -XKBCOMMON +UTMP +LIBARCHIVE) Sep 3 18:37:38.515442 systemd[1]: Detected virtualization microsoft. Sep 3 18:37:38.515449 systemd[1]: Detected architecture arm64. Sep 3 18:37:38.515459 systemd[1]: Detected first boot. Sep 3 18:37:38.515466 systemd[1]: Initializing machine ID from random generator. Sep 3 18:37:38.515475 systemd[1]: Hostname set to . Sep 3 18:37:38.515484 kernel: kauditd_printk_skb: 30 callbacks suppressed Sep 3 18:37:38.515491 kernel: audit: type=1334 audit(1788460655.418:85): prog-id=9 op=LOAD Sep 3 18:37:38.515498 kernel: audit: type=1334 audit(1788460655.418:86): prog-id=9 op=UNLOAD Sep 3 18:37:38.515507 zram_generator::config[1706]: No configuration found. Sep 3 18:37:38.515517 kernel: NET: Registered PF_VSOCK protocol family Sep 3 18:37:38.515523 systemd[1]: Applying preset policy. Sep 3 18:37:38.515529 systemd[1]: Populated /etc with preset unit settings. Sep 3 18:37:38.515536 kernel: audit: type=1334 audit(1788460657.591:87): prog-id=10 op=LOAD Sep 3 18:37:38.515542 kernel: audit: type=1334 audit(1788460657.591:88): prog-id=2 op=UNLOAD Sep 3 18:37:38.515550 kernel: audit: type=1334 audit(1788460657.591:89): prog-id=11 op=LOAD Sep 3 18:37:38.515557 kernel: audit: type=1334 audit(1788460657.591:90): prog-id=12 op=LOAD Sep 3 18:37:38.515563 kernel: audit: type=1334 audit(1788460657.591:91): prog-id=3 op=UNLOAD Sep 3 18:37:38.515569 kernel: audit: type=1334 audit(1788460657.591:92): prog-id=4 op=UNLOAD Sep 3 18:37:38.515575 kernel: audit: type=1334 audit(1788460657.591:93): prog-id=13 op=LOAD Sep 3 18:37:38.515581 kernel: audit: type=1334 audit(1788460657.591:94): prog-id=10 op=UNLOAD Sep 3 18:37:38.515588 systemd[1]: initrd-switch-root.service: Deactivated successfully. Sep 3 18:37:38.515594 systemd[1]: Stopped initrd-switch-root.service - Switch Root. Sep 3 18:37:38.515600 systemd[1]: systemd-journald.service: Scheduled restart job, restart counter is at 1. Sep 3 18:37:38.515609 systemd[1]: Created slice system-addon\x2dconfig.slice - Slice /system/addon-config. Sep 3 18:37:38.515616 systemd[1]: Created slice system-addon\x2drun.slice - Slice /system/addon-run. Sep 3 18:37:38.515623 systemd[1]: Created slice system-getty.slice - Slice /system/getty. Sep 3 18:37:38.515631 systemd[1]: Created slice system-modprobe.slice - Slice /system/modprobe. Sep 3 18:37:38.515641 systemd[1]: Created slice system-serial\x2dgetty.slice - Slice /system/serial-getty. Sep 3 18:37:38.515649 systemd[1]: Created slice system-system\x2dcloudinit.slice - Slice /system/system-cloudinit. Sep 3 18:37:38.515655 systemd[1]: Created slice system-systemd\x2dfsck.slice - Slice /system/systemd-fsck. Sep 3 18:37:38.515661 systemd[1]: Created slice user.slice - User and Session Slice. Sep 3 18:37:38.515667 systemd[1]: Started clevis-luks-askpass.path - Forward Password Requests to Clevis Directory Watch. Sep 3 18:37:38.515676 systemd[1]: Started systemd-ask-password-console.path - Dispatch Password Requests to Console Directory Watch. Sep 3 18:37:38.515683 systemd[1]: Started systemd-ask-password-wall.path - Forward Password Requests to Wall Directory Watch. Sep 3 18:37:38.515689 systemd[1]: Set up automount boot.automount - Boot partition Automount Point. Sep 3 18:37:38.515697 systemd[1]: Set up automount proc-sys-fs-binfmt_misc.automount - Arbitrary Executable File Formats File System Automount Point. Sep 3 18:37:38.515704 systemd[1]: Expecting device dev-disk-by\x2dlabel-OEM.device - /dev/disk/by-label/OEM... Sep 3 18:37:38.515710 systemd[1]: Expecting device dev-ptp_hyperv.device - /dev/ptp_hyperv... Sep 3 18:37:38.515717 systemd[1]: Expecting device dev-ttyAMA0.device - /dev/ttyAMA0... Sep 3 18:37:38.515723 systemd[1]: Reached target cryptsetup-pre.target - Local Encrypted Volumes (Pre). Sep 3 18:37:38.515732 systemd[1]: Reached target cryptsetup.target - Local Encrypted Volumes. Sep 3 18:37:38.515738 systemd[1]: Reached target imports.target - Image Downloads. Sep 3 18:37:38.515744 systemd[1]: Stopped target initrd-switch-root.target - Switch Root. Sep 3 18:37:38.515752 systemd[1]: Stopped target initrd-fs.target - Initrd File Systems. Sep 3 18:37:38.515760 systemd[1]: Stopped target initrd-root-fs.target - Initrd Root File System. Sep 3 18:37:38.515766 systemd[1]: Reached target integritysetup.target - Local Integrity Protected Volumes. Sep 3 18:37:38.515775 systemd[1]: Reached target remote-cryptsetup.target - Remote Encrypted Volumes. Sep 3 18:37:38.515781 systemd[1]: Reached target remote-fs.target - Remote File Systems. Sep 3 18:37:38.515787 systemd[1]: Reached target remote-integritysetup.target - Remote Integrity Protected Volumes. Sep 3 18:37:38.515795 systemd[1]: Reached target remote-veritysetup.target - Remote Verity Protected Volumes. Sep 3 18:37:38.515803 systemd[1]: Reached target slices.target - Slice Units. Sep 3 18:37:38.515809 systemd[1]: Reached target swap.target - Swaps. Sep 3 18:37:38.515816 systemd[1]: Reached target veritysetup.target - Local Verity Protected Volumes. Sep 3 18:37:38.515822 systemd[1]: Listening on systemd-ask-password.socket - Query the User Interactively for a Password. Sep 3 18:37:38.515828 systemd[1]: Listening on systemd-coredump.socket - Process Core Dump Socket. Sep 3 18:37:38.515836 systemd[1]: Listening on systemd-creds.socket - Credential Encryption/Decryption. Sep 3 18:37:38.515843 systemd[1]: Listening on systemd-factory-reset.socket - Factory Reset Management. Sep 3 18:37:38.515850 systemd[1]: Listening on systemd-journald-audit.socket - Journal Audit Socket. Sep 3 18:37:38.515856 systemd[1]: Listening on systemd-mountfsd.socket - DDI File System Mounter Socket. Sep 3 18:37:38.515863 systemd[1]: Listening on systemd-mute-console.socket - Console Output Muting Service Socket. Sep 3 18:37:38.515869 systemd[1]: Listening on systemd-networkd-resolve-hook.socket - Network Management Resolve Hook Socket. Sep 3 18:37:38.515876 systemd[1]: Listening on systemd-networkd-varlink-metrics.socket - Network Management Metrics Varlink Socket. Sep 3 18:37:38.515882 systemd[1]: Listening on systemd-networkd-varlink.socket - Network Management Varlink Socket. Sep 3 18:37:38.515890 systemd[1]: Listening on systemd-networkd.socket - Network Management Netlink Socket. Sep 3 18:37:38.515896 systemd[1]: Listening on systemd-nsresourced.socket - Namespace Resource Manager Socket. Sep 3 18:37:38.515902 systemd[1]: Listening on systemd-oomd.socket - Userspace Out-Of-Memory (OOM) Killer Socket. Sep 3 18:37:38.515909 systemd[1]: Listening on systemd-repart.socket - Disk Repartitioning Service Socket. Sep 3 18:37:38.515915 systemd[1]: Listening on systemd-resolved-monitor.socket - Resolve Monitor Varlink Socket. Sep 3 18:37:38.515921 systemd[1]: Listening on systemd-resolved-varlink.socket - Resolve Service Varlink Socket. Sep 3 18:37:38.515929 systemd[1]: Listening on systemd-udevd-control.socket - udev Control Socket. Sep 3 18:37:38.515935 systemd[1]: Listening on systemd-udevd-varlink.socket - udev Varlink Socket. Sep 3 18:37:38.515942 systemd[1]: Listening on systemd-userdbd.socket - User Database Manager Socket. Sep 3 18:37:38.515948 systemd[1]: Mounting dev-hugepages.mount - Huge Pages File System... Sep 3 18:37:38.515954 systemd[1]: Mounting dev-mqueue.mount - POSIX Message Queue File System... Sep 3 18:37:38.515960 systemd[1]: Mounting media.mount - External Media Directory... Sep 3 18:37:38.515967 systemd[1]: Mounting sys-kernel-debug.mount - Kernel Debug File System... Sep 3 18:37:38.515974 systemd[1]: Mounting sys-kernel-tracing.mount - Kernel Trace File System... Sep 3 18:37:38.515981 systemd[1]: tmp.mount: x-systemd.graceful-option=usrquota specified, but option is not available, suppressing. Sep 3 18:37:38.515987 systemd[1]: Mounting tmp.mount - Temporary Directory /tmp... Sep 3 18:37:38.515993 systemd[1]: Starting flatcar-tmpfiles.service - Create missing system files... Sep 3 18:37:38.516001 systemd[1]: ignition-delete-config.service - Ignition (delete config) skipped, no trigger condition checks were met. Sep 3 18:37:38.516008 systemd[1]: Starting kmod-static-nodes.service - Create List of Static Device Nodes... Sep 3 18:37:38.516016 systemd[1]: Starting modprobe@configfs.service - Load Kernel Module configfs... Sep 3 18:37:38.516023 systemd[1]: modprobe@drm.service - Load Kernel Module drm skipped, unmet condition check ConditionKernelModuleLoaded=!drm Sep 3 18:37:38.516030 systemd[1]: Starting modprobe@efi_pstore.service - Load Kernel Module efi_pstore... Sep 3 18:37:38.516036 systemd[1]: Starting modprobe@fuse.service - Load Kernel Module fuse... Sep 3 18:37:38.516044 systemd[1]: setup-nsswitch.service - Create /etc/nsswitch.conf skipped, unmet condition check ConditionPathExists=!/etc/nsswitch.conf Sep 3 18:37:38.516050 systemd[1]: systemd-fsck-root.service: Deactivated successfully. Sep 3 18:37:38.516057 systemd[1]: Stopped systemd-fsck-root.service - File System Check on Root Device. Sep 3 18:37:38.516064 systemd[1]: systemd-hibernate-clear.service - Clear Stale Hibernate Storage Info skipped, unmet condition check ConditionPathExists=/sys/firmware/efi/efivars/HibernateLocation-8cf2644b-4b0b-428f-9387-6d876050dc67 Sep 3 18:37:38.516071 systemd[1]: Starting systemd-journald.service - Journal Service... Sep 3 18:37:38.516099 systemd[1]: Starting systemd-modules-load.service - Load Kernel Modules... Sep 3 18:37:38.516106 kernel: fuse: init (API version 7.41) Sep 3 18:37:38.516112 systemd[1]: Starting systemd-network-generator.service - Generate Network Units from Kernel Command Line... Sep 3 18:37:38.516118 systemd[1]: Reached target time-set.target - System Time Set. Sep 3 18:37:38.516157 systemd-journald[1785]: Collecting audit messages is enabled. Sep 3 18:37:38.516172 systemd[1]: Starting systemd-remount-fs.service - Remount Root and Kernel File Systems... Sep 3 18:37:38.516182 systemd-journald[1785]: Journal started Sep 3 18:37:38.516198 systemd-journald[1785]: Runtime Journal (/run/log/journal/dbb49fa940534fa4a9641708d3fee93e) is 8M, max 78.3M, 70.3M free. Sep 3 18:37:38.031000 audit[1]: EVENT_LISTENER pid=1 uid=0 auid=4294967295 tty=(none) ses=4294967295 subj=system_u:system_r:kernel_t:s0 comm="systemd" exe="/usr/lib/systemd/systemd" nl-mcgrp=1 op=connect res=1 Sep 3 18:37:38.427000 audit[1]: SERVICE_STOP pid=1 uid=0 auid=4294967295 ses=4294967295 subj=system_u:system_r:kernel_t:s0 msg='unit=systemd-fsck-root comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Sep 3 18:37:38.440000 audit: BPF prog-id=15 op=UNLOAD Sep 3 18:37:38.440000 audit: BPF prog-id=14 op=UNLOAD Sep 3 18:37:38.440000 audit: BPF prog-id=16 op=LOAD Sep 3 18:37:38.440000 audit: BPF prog-id=17 op=LOAD Sep 3 18:37:38.440000 audit: BPF prog-id=18 op=LOAD Sep 3 18:37:38.510000 audit: CONFIG_CHANGE op=set audit_enabled=1 old=1 auid=4294967295 ses=4294967295 subj=system_u:system_r:kernel_t:s0 res=1 Sep 3 18:37:38.510000 audit[1785]: SYSCALL arch=c00000b7 syscall=211 success=yes exit=60 a0=6 a1=fffffc97dc40 a2=4000 a3=0 items=0 ppid=1 pid=1785 auid=4294967295 uid=0 gid=0 euid=0 suid=0 fsuid=0 egid=0 sgid=0 fsgid=0 tty=(none) ses=4294967295 comm="systemd-journal" exe="/usr/lib/systemd/systemd-journald" subj=system_u:system_r:kernel_t:s0 key=(null) Sep 3 18:37:38.510000 audit: PROCTITLE proctitle="/usr/lib/systemd/systemd-journald" Sep 3 18:37:37.536288 systemd[1]: Queued start job for default target multi-user.target. Sep 3 18:37:37.597423 systemd[1]: Unnecessary job was removed for dev-sda6.device - /dev/sda6. Sep 3 18:37:37.598412 systemd[1]: systemd-journald.service: Deactivated successfully. Sep 3 18:37:37.651559 systemd[1]: systemd-journald.service: Consumed 2.517s CPU time over 23.117s wall clock time. Sep 3 18:37:38.506634 systemd-modules-load[1787]: Using 2 probe threads Sep 3 18:37:38.545022 systemd[1]: Starting systemd-udev-load-credentials.service - Load udev Rules from Credentials... Sep 3 18:37:38.561069 systemd[1]: Starting systemd-udev-trigger.service - Coldplug All udev Devices... Sep 3 18:37:38.572846 systemd[1]: Started systemd-journald.service - Journal Service. Sep 3 18:37:38.572000 audit[1]: SERVICE_START pid=1 uid=0 auid=4294967295 ses=4294967295 subj=system_u:system_r:kernel_t:s0 msg='unit=systemd-journald comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Sep 3 18:37:38.574007 systemd[1]: Mounted dev-hugepages.mount - Huge Pages File System. Sep 3 18:37:38.579414 systemd[1]: Mounted dev-mqueue.mount - POSIX Message Queue File System. Sep 3 18:37:38.584250 systemd[1]: Mounted media.mount - External Media Directory. Sep 3 18:37:38.588629 systemd[1]: Mounted sys-kernel-debug.mount - Kernel Debug File System. Sep 3 18:37:38.594450 systemd[1]: Mounted sys-kernel-tracing.mount - Kernel Trace File System. Sep 3 18:37:38.599407 systemd[1]: Mounted tmp.mount - Temporary Directory /tmp. Sep 3 18:37:38.603586 systemd[1]: Finished kmod-static-nodes.service - Create List of Static Device Nodes. Sep 3 18:37:38.607000 audit[1]: SERVICE_START pid=1 uid=0 auid=4294967295 ses=4294967295 subj=system_u:system_r:kernel_t:s0 msg='unit=kmod-static-nodes comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Sep 3 18:37:38.609474 systemd[1]: modprobe@configfs.service: Deactivated successfully. Sep 3 18:37:38.609634 systemd[1]: Finished modprobe@configfs.service - Load Kernel Module configfs. Sep 3 18:37:38.613000 audit[1]: SERVICE_START pid=1 uid=0 auid=4294967295 ses=4294967295 subj=system_u:system_r:kernel_t:s0 msg='unit=modprobe@configfs comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Sep 3 18:37:38.613000 audit[1]: SERVICE_STOP pid=1 uid=0 auid=4294967295 ses=4294967295 subj=system_u:system_r:kernel_t:s0 msg='unit=modprobe@configfs comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Sep 3 18:37:38.614892 systemd[1]: modprobe@efi_pstore.service: Deactivated successfully. Sep 3 18:37:38.615047 systemd[1]: Finished modprobe@efi_pstore.service - Load Kernel Module efi_pstore. Sep 3 18:37:38.618000 audit[1]: SERVICE_START pid=1 uid=0 auid=4294967295 ses=4294967295 subj=system_u:system_r:kernel_t:s0 msg='unit=modprobe@efi_pstore comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Sep 3 18:37:38.618000 audit[1]: SERVICE_STOP pid=1 uid=0 auid=4294967295 ses=4294967295 subj=system_u:system_r:kernel_t:s0 msg='unit=modprobe@efi_pstore comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Sep 3 18:37:38.620216 systemd[1]: modprobe@fuse.service: Deactivated successfully. Sep 3 18:37:38.620353 systemd[1]: Finished modprobe@fuse.service - Load Kernel Module fuse. Sep 3 18:37:38.624000 audit[1]: SERVICE_START pid=1 uid=0 auid=4294967295 ses=4294967295 subj=system_u:system_r:kernel_t:s0 msg='unit=modprobe@fuse comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Sep 3 18:37:38.624000 audit[1]: SERVICE_STOP pid=1 uid=0 auid=4294967295 ses=4294967295 subj=system_u:system_r:kernel_t:s0 msg='unit=modprobe@fuse comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Sep 3 18:37:38.625973 systemd[1]: Finished systemd-modules-load.service - Load Kernel Modules. Sep 3 18:37:38.629000 audit[1]: SERVICE_START pid=1 uid=0 auid=4294967295 ses=4294967295 subj=system_u:system_r:kernel_t:s0 msg='unit=systemd-modules-load comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Sep 3 18:37:38.631250 systemd[1]: Finished systemd-network-generator.service - Generate Network Units from Kernel Command Line. Sep 3 18:37:38.635000 audit[1]: SERVICE_START pid=1 uid=0 auid=4294967295 ses=4294967295 subj=system_u:system_r:kernel_t:s0 msg='unit=systemd-network-generator comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Sep 3 18:37:38.637663 systemd[1]: Finished systemd-remount-fs.service - Remount Root and Kernel File Systems. Sep 3 18:37:38.642000 audit[1]: SERVICE_START pid=1 uid=0 auid=4294967295 ses=4294967295 subj=system_u:system_r:kernel_t:s0 msg='unit=systemd-remount-fs comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Sep 3 18:37:38.649253 systemd[1]: Reached target network-pre.target - Preparation for Network. Sep 3 18:37:38.655421 systemd[1]: Mounting sys-fs-fuse-connections.mount - FUSE Control File System... Sep 3 18:37:38.665484 systemd[1]: Mounting sys-kernel-config.mount - Kernel Configuration File System... Sep 3 18:37:38.670432 systemd[1]: remount-root.service - Remount Root File System skipped, unmet condition check ConditionPathIsReadWrite=!/ Sep 3 18:37:38.796820 systemd[1]: Starting systemd-hwdb-update.service - Rebuild Hardware Database... Sep 3 18:37:38.804622 systemd[1]: Starting systemd-journal-flush.service - Flush Journal to Persistent Storage... Sep 3 18:37:38.813999 systemd[1]: systemd-pstore.service - Platform Persistent Storage Archival skipped, unmet condition check ConditionDirectoryNotEmpty=/sys/fs/pstore Sep 3 18:37:38.816615 systemd[1]: Starting systemd-random-seed.service - Load/Save OS Random Seed... Sep 3 18:37:38.825992 systemd[1]: Starting systemd-sysctl.service - Apply Kernel Variables... Sep 3 18:37:38.842691 systemd[1]: Starting systemd-tmpfiles-setup-dev-early.service - Create Static Device Nodes in /dev gracefully... Sep 3 18:37:38.852639 systemd[1]: Finished systemd-udev-load-credentials.service - Load udev Rules from Credentials. Sep 3 18:37:38.857000 audit[1]: SERVICE_START pid=1 uid=0 auid=4294967295 ses=4294967295 subj=system_u:system_r:kernel_t:s0 msg='unit=systemd-udev-load-credentials comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Sep 3 18:37:38.860284 systemd[1]: Mounted sys-fs-fuse-connections.mount - FUSE Control File System. Sep 3 18:37:38.865600 systemd[1]: Mounted sys-kernel-config.mount - Kernel Configuration File System. Sep 3 18:37:38.885898 systemd[1]: Finished systemd-udev-trigger.service - Coldplug All udev Devices. Sep 3 18:37:38.889000 audit[1]: SERVICE_START pid=1 uid=0 auid=4294967295 ses=4294967295 subj=system_u:system_r:kernel_t:s0 msg='unit=systemd-udev-trigger comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Sep 3 18:37:39.195081 systemd-journald[1785]: Time spent on flushing to /var/log/journal/dbb49fa940534fa4a9641708d3fee93e is 16.827ms for 1176 entries. Sep 3 18:37:39.195081 systemd-journald[1785]: System Journal (/var/log/journal/dbb49fa940534fa4a9641708d3fee93e) is 8M, max 2.2G, 2.2G free. Sep 3 18:37:39.501000 audit[1]: SERVICE_START pid=1 uid=0 auid=4294967295 ses=4294967295 subj=system_u:system_r:kernel_t:s0 msg='unit=flatcar-tmpfiles comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Sep 3 18:37:39.550000 audit[1]: SERVICE_START pid=1 uid=0 auid=4294967295 ses=4294967295 subj=system_u:system_r:kernel_t:s0 msg='unit=systemd-random-seed comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Sep 3 18:37:39.588000 audit[1]: SERVICE_START pid=1 uid=0 auid=4294967295 ses=4294967295 subj=system_u:system_r:kernel_t:s0 msg='unit=systemd-sysctl comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Sep 3 18:37:40.098224 systemd-journald[1785]: Received client request to flush runtime journal. Sep 3 18:37:39.498168 systemd[1]: Finished flatcar-tmpfiles.service - Create missing system files. Sep 3 18:37:39.546656 systemd[1]: Finished systemd-random-seed.service - Load/Save OS Random Seed. Sep 3 18:37:39.552026 systemd[1]: Reached target first-boot-complete.target - First Boot Complete. Sep 3 18:37:39.584103 systemd[1]: Finished systemd-sysctl.service - Apply Kernel Variables. Sep 3 18:37:40.099532 systemd[1]: Finished systemd-journal-flush.service - Flush Journal to Persistent Storage. Sep 3 18:37:40.103000 audit[1]: SERVICE_START pid=1 uid=0 auid=4294967295 ses=4294967295 subj=system_u:system_r:kernel_t:s0 msg='unit=systemd-journal-flush comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Sep 3 18:37:40.114429 systemd-tmpfiles[1835]: ACLs are not supported, ignoring. Sep 3 18:37:40.114438 systemd-tmpfiles[1835]: ACLs are not supported, ignoring. Sep 3 18:37:40.118502 systemd[1]: Finished systemd-tmpfiles-setup-dev-early.service - Create Static Device Nodes in /dev gracefully. Sep 3 18:37:40.122000 audit[1]: SERVICE_START pid=1 uid=0 auid=4294967295 ses=4294967295 subj=system_u:system_r:kernel_t:s0 msg='unit=systemd-tmpfiles-setup-dev-early comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Sep 3 18:37:40.126411 systemd[1]: Starting systemd-sysusers.service - Create System Users... Sep 3 18:37:40.804545 systemd[1]: Finished systemd-sysusers.service - Create System Users. Sep 3 18:37:40.808000 audit[1]: SERVICE_START pid=1 uid=0 auid=4294967295 ses=4294967295 subj=system_u:system_r:kernel_t:s0 msg='unit=systemd-sysusers comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Sep 3 18:37:40.812386 kernel: kauditd_printk_skb: 36 callbacks suppressed Sep 3 18:37:40.812467 kernel: audit: type=1130 audit(1788460660.808:129): pid=1 uid=0 auid=4294967295 ses=4294967295 subj=system_u:system_r:kernel_t:s0 msg='unit=systemd-sysusers comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Sep 3 18:37:40.813373 systemd[1]: Starting systemd-journalctl.socket - Journal Log Access Socket... Sep 3 18:37:40.834000 audit: BPF prog-id=19 op=LOAD Sep 3 18:37:40.838000 audit: BPF prog-id=20 op=LOAD Sep 3 18:37:40.843512 kernel: audit: type=1334 audit(1788460660.834:130): prog-id=19 op=LOAD Sep 3 18:37:40.843586 kernel: audit: type=1334 audit(1788460660.838:131): prog-id=20 op=LOAD Sep 3 18:37:40.842000 audit: BPF prog-id=21 op=LOAD Sep 3 18:37:40.848461 kernel: audit: type=1334 audit(1788460660.842:132): prog-id=21 op=LOAD Sep 3 18:37:40.848552 systemd[1]: Starting systemd-oomd.service - Userspace Out-Of-Memory (OOM) Killer... Sep 3 18:37:40.853000 audit: BPF prog-id=22 op=LOAD Sep 3 18:37:40.859739 systemd[1]: Starting systemd-resolved.service - Network Name Resolution... Sep 3 18:37:40.860515 kernel: audit: type=1334 audit(1788460660.853:133): prog-id=22 op=LOAD Sep 3 18:37:40.868190 systemd[1]: Starting systemd-tmpfiles-setup-dev.service - Create Static Device Nodes in /dev... Sep 3 18:37:40.875169 systemd[1]: Listening on systemd-journalctl.socket - Journal Log Access Socket. Sep 3 18:37:40.891528 systemd[1]: Starting modprobe@tun.service - Load Kernel Module tun... Sep 3 18:37:40.897770 systemd-tmpfiles[1853]: ACLs are not supported, ignoring. Sep 3 18:37:40.898092 systemd-tmpfiles[1853]: ACLs are not supported, ignoring. Sep 3 18:37:40.896000 audit: BPF prog-id=23 op=LOAD Sep 3 18:37:40.903843 systemd[1]: Starting systemd-userdbd.service - User Database Manager... Sep 3 18:37:40.896000 audit: BPF prog-id=24 op=LOAD Sep 3 18:37:40.911149 kernel: audit: type=1334 audit(1788460660.896:134): prog-id=23 op=LOAD Sep 3 18:37:40.911183 kernel: audit: type=1334 audit(1788460660.896:135): prog-id=24 op=LOAD Sep 3 18:37:40.896000 audit: BPF prog-id=25 op=LOAD Sep 3 18:37:40.915165 kernel: audit: type=1334 audit(1788460660.896:136): prog-id=25 op=LOAD Sep 3 18:37:40.920056 systemd[1]: Finished systemd-tmpfiles-setup-dev.service - Create Static Device Nodes in /dev. Sep 3 18:37:40.926000 audit[1]: SERVICE_START pid=1 uid=0 auid=4294967295 ses=4294967295 subj=system_u:system_r:kernel_t:s0 msg='unit=systemd-tmpfiles-setup-dev comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Sep 3 18:37:40.929502 systemd[1]: proc-sys-fs-binfmt_misc.automount: Got automount request for /proc/sys/fs/binfmt_misc, triggered by 1855 ((systemd-userd)) Sep 3 18:37:40.930110 systemd[1]: Reached target local-fs-pre.target - Preparation for Local File Systems. Sep 3 18:37:40.947337 kernel: audit: type=1130 audit(1788460660.926:137): pid=1 uid=0 auid=4294967295 ses=4294967295 subj=system_u:system_r:kernel_t:s0 msg='unit=systemd-tmpfiles-setup-dev comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Sep 3 18:37:40.948972 systemd[1]: Mounting proc-sys-fs-binfmt_misc.mount - Arbitrary Executable File Formats File System... Sep 3 18:37:40.953990 systemd[1]: var-lib-machines.mount - Virtual Machine and Container Storage (Compatibility) skipped, unmet condition check ConditionPathExists=/var/lib/machines.raw Sep 3 18:37:40.954023 systemd[1]: Reached target local-fs.target - Local File Systems. Sep 3 18:37:40.958425 systemd[1]: Reached target machines.target - Virtual Machines and Containers. Sep 3 18:37:40.964048 systemd[1]: Listening on systemd-importd.socket - Disk Image Download Service Socket. Sep 3 18:37:40.970779 systemd[1]: Listening on systemd-sysext.socket - System Extension Image Management. Sep 3 18:37:40.977290 systemd[1]: Starting systemd-confext.service - Merge System Configuration Images into /etc/... Sep 3 18:37:40.991540 systemd[1]: Starting systemd-machine-id-commit.service - Save Transient machine-id to Disk... Sep 3 18:37:40.998281 systemd[1]: systemd-repart.service - Repartition Root Disk skipped, no trigger condition checks were met. Sep 3 18:37:40.999301 systemd[1]: Starting systemd-userdb-load-credentials.service - Load JSON user/group Records from Credentials... Sep 3 18:37:41.655838 systemd[1]: Mounted proc-sys-fs-binfmt_misc.mount - Arbitrary Executable File Formats File System. Sep 3 18:37:41.666863 systemd[1]: systemd-binfmt.service - Set Up Additional Binary Formats skipped, no trigger condition checks were met. Sep 3 18:37:41.668518 systemd[1]: Finished systemd-userdb-load-credentials.service - Load JSON user/group Records from Credentials. Sep 3 18:37:41.676000 audit[1]: SERVICE_START pid=1 uid=0 auid=4294967295 ses=4294967295 subj=system_u:system_r:kernel_t:s0 msg='unit=systemd-userdb-load-credentials comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Sep 3 18:37:41.679392 systemd[1]: Finished systemd-hwdb-update.service - Rebuild Hardware Database. Sep 3 18:37:41.692400 kernel: loop4: detected capacity change from 0 to 44096 Sep 3 18:37:41.692503 kernel: audit: type=1130 audit(1788460661.676:138): pid=1 uid=0 auid=4294967295 ses=4294967295 subj=system_u:system_r:kernel_t:s0 msg='unit=systemd-userdb-load-credentials comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Sep 3 18:37:41.692529 kernel: loop4: p1 p2 p3 Sep 3 18:37:41.700000 audit[1]: SERVICE_START pid=1 uid=0 auid=4294967295 ses=4294967295 subj=system_u:system_r:kernel_t:s0 msg='unit=systemd-hwdb-update comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Sep 3 18:37:41.701000 audit: BPF prog-id=7 op=UNLOAD Sep 3 18:37:41.701000 audit: BPF prog-id=6 op=UNLOAD Sep 3 18:37:41.701000 audit: BPF prog-id=26 op=LOAD Sep 3 18:37:41.701000 audit: BPF prog-id=27 op=LOAD Sep 3 18:37:41.706804 systemd[1]: Starting systemd-udevd.service - Rule-based Manager for Device Events and Files... Sep 3 18:37:41.728111 systemd[1]: Started systemd-userdbd.service - User Database Manager. Sep 3 18:37:41.733000 audit[1]: SERVICE_START pid=1 uid=0 auid=4294967295 ses=4294967295 subj=system_u:system_r:kernel_t:s0 msg='unit=systemd-userdbd comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Sep 3 18:37:41.739370 kernel: tun: Universal TUN/TAP device driver, 1.6 Sep 3 18:37:41.740608 systemd[1]: modprobe@tun.service: Deactivated successfully. Sep 3 18:37:41.742398 systemd[1]: Finished modprobe@tun.service - Load Kernel Module tun. Sep 3 18:37:41.746000 audit[1]: SERVICE_START pid=1 uid=0 auid=4294967295 ses=4294967295 subj=system_u:system_r:kernel_t:s0 msg='unit=modprobe@tun comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Sep 3 18:37:41.746000 audit[1]: SERVICE_STOP pid=1 uid=0 auid=4294967295 ses=4294967295 subj=system_u:system_r:kernel_t:s0 msg='unit=modprobe@tun comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Sep 3 18:37:41.747000 audit: BPF prog-id=28 op=LOAD Sep 3 18:37:41.747000 audit: BPF prog-id=29 op=LOAD Sep 3 18:37:41.747000 audit: BPF prog-id=30 op=LOAD Sep 3 18:37:41.749584 systemd[1]: Starting systemd-nsresourced.service - Namespace Resource Manager... Sep 3 18:37:41.796610 systemd-nsresourced[1876]: Not setting up BPF subsystem, as functionality has been disabled at compile time. Sep 3 18:37:41.798143 systemd[1]: Started systemd-nsresourced.service - Namespace Resource Manager. Sep 3 18:37:41.801000 audit[1]: SERVICE_START pid=1 uid=0 auid=4294967295 ses=4294967295 subj=system_u:system_r:kernel_t:s0 msg='unit=systemd-nsresourced comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Sep 3 18:37:41.919058 kernel: device-mapper: verity: sha256 using shash "sha256-ce" Sep 3 18:37:41.919144 kernel: device-mapper: verity: Unrecognized verity feature request: root_hash_sig_key_desc Sep 3 18:37:41.923868 kernel: device-mapper: table: 254:5: verity: Unrecognized verity feature request (-EINVAL) Sep 3 18:37:41.927599 kernel: device-mapper: ioctl: error adding target to table Sep 3 18:37:41.927843 systemd-confext[1863]: device-mapper: reload ioctl on loop4p1-53-verity (254:5) failed: Invalid argument Sep 3 18:37:41.934382 kernel: device-mapper: verity: sha256 using shash "sha256-ce" Sep 3 18:37:41.956130 systemd-oomd[1851]: No swap; memory pressure usage will be degraded Sep 3 18:37:41.957449 systemd[1]: Started systemd-oomd.service - Userspace Out-Of-Memory (OOM) Killer. Sep 3 18:37:41.962000 audit[1]: SERVICE_START pid=1 uid=0 auid=4294967295 ses=4294967295 subj=system_u:system_r:kernel_t:s0 msg='unit=systemd-oomd comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Sep 3 18:37:42.102309 systemd-resolved[1852]: Positive Trust Anchors: Sep 3 18:37:42.102332 systemd-resolved[1852]: . IN DS 20326 8 2 e06d44b80b8f1d39a95c0b0d7c65d08458e880409bbc683457104237c7f8ec8d Sep 3 18:37:42.102335 systemd-resolved[1852]: . IN DS 38696 8 2 683d2d0acb8c9b712a1948b27f741219298d0a450d612c483af444a4c0fb2b16 Sep 3 18:37:42.102355 systemd-resolved[1852]: Negative trust anchors: home.arpa 10.in-addr.arpa 16.172.in-addr.arpa 17.172.in-addr.arpa 18.172.in-addr.arpa 19.172.in-addr.arpa 20.172.in-addr.arpa 21.172.in-addr.arpa 22.172.in-addr.arpa 23.172.in-addr.arpa 24.172.in-addr.arpa 25.172.in-addr.arpa 26.172.in-addr.arpa 27.172.in-addr.arpa 28.172.in-addr.arpa 29.172.in-addr.arpa 30.172.in-addr.arpa 31.172.in-addr.arpa 170.0.0.192.in-addr.arpa 171.0.0.192.in-addr.arpa 168.192.in-addr.arpa d.f.ip6.arpa ipv4only.arpa resolver.arpa corp home internal intranet lan local private test Sep 3 18:37:43.097939 systemd-resolved[1852]: Using system hostname 'ci-9999.0.0-i-e5ff979d07'. Sep 3 18:37:43.099264 systemd[1]: Started systemd-resolved.service - Network Name Resolution. Sep 3 18:37:43.103000 audit[1]: SERVICE_START pid=1 uid=0 auid=4294967295 ses=4294967295 subj=system_u:system_r:kernel_t:s0 msg='unit=systemd-resolved comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Sep 3 18:37:43.104767 systemd[1]: Reached target nss-lookup.target - Host and Network Name Lookups. Sep 3 18:37:43.112891 systemd-udevd[1869]: Using default interface naming scheme 'v260'. Sep 3 18:37:45.460498 systemd[1]: Started systemd-udevd.service - Rule-based Manager for Device Events and Files. Sep 3 18:37:45.465000 audit[1]: SERVICE_START pid=1 uid=0 auid=4294967295 ses=4294967295 subj=system_u:system_r:kernel_t:s0 msg='unit=systemd-udevd comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Sep 3 18:37:45.466000 audit: BPF prog-id=31 op=LOAD Sep 3 18:37:45.469523 systemd[1]: Starting systemd-networkd.service - Network Management... Sep 3 18:37:45.576200 systemd[1]: Condition check resulted in dev-ttyAMA0.device - /dev/ttyAMA0 being skipped. Sep 3 18:37:46.103000 audit[1]: SERVICE_START pid=1 uid=0 auid=4294967295 ses=4294967295 subj=system_u:system_r:kernel_t:s0 msg='unit=systemd-networkd comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Sep 3 18:37:46.338308 kernel: hv_vmbus: registering driver hyperv_fb Sep 3 18:37:46.094835 systemd-networkd[1889]: lo: Link UP Sep 3 18:37:46.338790 kernel: hyperv_fb: Synthvid Version major 3, minor 5 Sep 3 18:37:46.094838 systemd-networkd[1889]: lo: Gained carrier Sep 3 18:37:46.338893 kernel: hyperv_fb: Screen resolution: 1024x768, Color depth: 32, Frame buffer size: 8388608 Sep 3 18:37:46.097085 systemd[1]: Started systemd-networkd.service - Network Management. Sep 3 18:37:46.338952 kernel: Console: switching to colour dummy device 80x25 Sep 3 18:37:46.102061 systemd-networkd[1889]: eth0: Configuring with /usr/lib/systemd/network/zz-default.network. Sep 3 18:37:46.339002 kernel: Console: switching to colour frame buffer device 128x48 Sep 3 18:37:46.105091 systemd[1]: Reached target network.target - Network. Sep 3 18:37:46.339049 kernel: hv_storvsc f8b3781a-1e82-4818-a1c3-63d806ec15bb: tag#71 cmd 0x85 status: scsi 0x2 srb 0x6 hv 0xc0000001 Sep 3 18:37:46.132834 systemd[1]: Starting systemd-networkd-persistent-storage.service - Enable Persistent Storage in systemd-networkd... Sep 3 18:37:46.339325 kernel: hv_vmbus: registering driver hv_balloon Sep 3 18:37:46.142811 systemd[1]: Starting systemd-networkd-wait-online.service - Wait for Network to be Online... Sep 3 18:37:46.339412 kernel: hv_balloon: Using Dynamic Memory protocol version 2.0 Sep 3 18:37:46.151458 systemd[1]: Condition check resulted in dev-ptp_hyperv.device - /dev/ptp_hyperv being skipped. Sep 3 18:37:46.339471 kernel: kauditd_printk_skb: 16 callbacks suppressed Sep 3 18:37:46.213528 systemd-networkd[1889]: enP57341s1: Link UP Sep 3 18:37:46.339511 kernel: audit: type=1130 audit(1788460666.103:155): pid=1 uid=0 auid=4294967295 ses=4294967295 subj=system_u:system_r:kernel_t:s0 msg='unit=systemd-networkd comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Sep 3 18:37:46.213676 systemd-networkd[1889]: eth0: Link UP Sep 3 18:37:46.339553 kernel: hv_balloon: Memory hot add disabled on ARM64 Sep 3 18:37:46.213680 systemd-networkd[1889]: eth0: Gained carrier Sep 3 18:37:46.339588 kernel: mousedev: PS/2 mouse device common for all mice Sep 3 18:37:46.222674 systemd-networkd[1889]: enP57341s1: Gained carrier Sep 3 18:37:46.339620 kernel: mlx5_core dffd:00:02.0 enP57341s1: Link up Sep 3 18:37:46.231410 systemd-networkd[1889]: eth0: DHCPv4 address 10.0.0.4/24, gateway 10.0.0.1 acquired from 168.63.129.16 Sep 3 18:37:46.339843 kernel: hv_netvsc 7ced8dc7-f8ba-7ced-8dc7-f8ba7ced8dc7 eth0: Data path switched to VF: enP57341s1 Sep 3 18:37:46.507136 systemd[1]: Starting systemd-vconsole-setup.service - Virtual Console Setup... Sep 3 18:37:46.518815 systemd[1]: systemd-vconsole-setup.service: Deactivated successfully. Sep 3 18:37:46.519045 systemd[1]: Stopped systemd-vconsole-setup.service - Virtual Console Setup. Sep 3 18:37:46.523000 audit[1]: SERVICE_START pid=1 uid=0 auid=4294967295 ses=4294967295 subj=system_u:system_r:kernel_t:s0 msg='unit=systemd-vconsole-setup comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Sep 3 18:37:46.529554 systemd[1]: Starting systemd-vconsole-setup.service - Virtual Console Setup... Sep 3 18:37:46.523000 audit[1]: SERVICE_STOP pid=1 uid=0 auid=4294967295 ses=4294967295 subj=system_u:system_r:kernel_t:s0 msg='unit=systemd-vconsole-setup comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Sep 3 18:37:46.536455 kernel: audit: type=1130 audit(1788460666.523:156): pid=1 uid=0 auid=4294967295 ses=4294967295 subj=system_u:system_r:kernel_t:s0 msg='unit=systemd-vconsole-setup comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Sep 3 18:37:46.536492 kernel: audit: type=1131 audit(1788460666.523:157): pid=1 uid=0 auid=4294967295 ses=4294967295 subj=system_u:system_r:kernel_t:s0 msg='unit=systemd-vconsole-setup comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Sep 3 18:37:46.559563 systemd[1]: Finished systemd-networkd-persistent-storage.service - Enable Persistent Storage in systemd-networkd. Sep 3 18:37:46.564000 audit[1]: SERVICE_START pid=1 uid=0 auid=4294967295 ses=4294967295 subj=system_u:system_r:kernel_t:s0 msg='unit=systemd-networkd-persistent-storage comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Sep 3 18:37:46.581381 kernel: audit: type=1130 audit(1788460666.564:158): pid=1 uid=0 auid=4294967295 ses=4294967295 subj=system_u:system_r:kernel_t:s0 msg='unit=systemd-networkd-persistent-storage comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Sep 3 18:37:46.897388 kernel: erofs: (device dm-5): mounted with root inode @ nid 40. Sep 3 18:37:46.904406 kernel: MACsec IEEE 802.1AE Sep 3 18:37:46.919389 kernel: loop4: detected capacity change from 0 to 44096 Sep 3 18:37:46.937900 kernel: loop4: p1 p2 p3 Sep 3 18:37:46.949489 kernel: device-mapper: verity: sha256 using shash "sha256-ce" Sep 3 18:37:46.949602 kernel: device-mapper: verity: Unrecognized verity feature request: root_hash_sig_key_desc Sep 3 18:37:46.954993 kernel: device-mapper: table: 254:5: verity: Unrecognized verity feature request (-EINVAL) Sep 3 18:37:46.958679 kernel: device-mapper: ioctl: error adding target to table Sep 3 18:37:46.958576 (sd-merge)[1966]: device-mapper: reload ioctl on loop4p1-58-verity (254:5) failed: Invalid argument Sep 3 18:37:46.965415 kernel: device-mapper: verity: sha256 using shash "sha256-ce" Sep 3 18:37:47.104394 kernel: erofs: (device dm-5): mounted with root inode @ nid 40. Sep 3 18:37:47.104428 (sd-merge)[1966]: Skipping extension refresh because no change was found, use --always-refresh=yes to always do a refresh. Sep 3 18:37:47.110444 systemd[1]: Finished systemd-confext.service - Merge System Configuration Images into /etc/. Sep 3 18:37:47.114000 audit[1]: SERVICE_START pid=1 uid=0 auid=4294967295 ses=4294967295 subj=system_u:system_r:kernel_t:s0 msg='unit=systemd-confext comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Sep 3 18:37:47.119655 systemd[1]: Starting systemd-sysext.service - Merge System Extension Images into /usr/ and /opt/... Sep 3 18:37:47.134264 kernel: audit: type=1130 audit(1788460667.114:159): pid=1 uid=0 auid=4294967295 ses=4294967295 subj=system_u:system_r:kernel_t:s0 msg='unit=systemd-confext comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Sep 3 18:37:47.149459 kernel: loop5: detected capacity change from 0 to 158496 Sep 3 18:37:47.154458 kernel: loop5: p1 p2 p3 Sep 3 18:37:47.167157 kernel: device-mapper: verity: sha256 using shash "sha256-ce" Sep 3 18:37:47.167246 kernel: device-mapper: verity: Unrecognized verity feature request: root_hash_sig_key_desc Sep 3 18:37:47.171870 kernel: device-mapper: table: 254:5: verity: Unrecognized verity feature request (-EINVAL) Sep 3 18:37:47.175793 kernel: device-mapper: ioctl: error adding target to table Sep 3 18:37:47.176082 systemd-sysext[1990]: device-mapper: reload ioctl on loop5p1-62-verity (254:5) failed: Invalid argument Sep 3 18:37:47.183403 kernel: device-mapper: verity: sha256 using shash "sha256-ce" Sep 3 18:37:47.211621 systemd[1]: Found device dev-disk-by\x2dlabel-OEM.device - Virtual_Disk OEM. Sep 3 18:37:47.217505 systemd[1]: Starting systemd-fsck@dev-disk-by\x2dlabel-OEM.service - File System Check on /dev/disk/by-label/OEM... Sep 3 18:37:47.465408 kernel: erofs: (device dm-5): mounted with root inode @ nid 39. Sep 3 18:37:47.566571 kernel: loop5: detected capacity change from 0 to 140928 Sep 3 18:37:47.566666 kernel: loop5: p1 p2 p3 Sep 3 18:37:47.579760 kernel: device-mapper: verity: sha256 using shash "sha256-ce" Sep 3 18:37:47.579857 kernel: device-mapper: verity: Unrecognized verity feature request: root_hash_sig_key_desc Sep 3 18:37:47.585816 kernel: device-mapper: table: 254:5: verity: Unrecognized verity feature request (-EINVAL) Sep 3 18:37:47.592205 kernel: device-mapper: ioctl: error adding target to table Sep 3 18:37:47.594419 systemd-sysext[1990]: device-mapper: reload ioctl on loop5p1-67-verity (254:5) failed: Invalid argument Sep 3 18:37:47.601393 kernel: device-mapper: verity: sha256 using shash "sha256-ce" Sep 3 18:37:47.634511 systemd-networkd[1889]: eth0: Gained IPv6LL Sep 3 18:37:47.639098 systemd[1]: Finished systemd-networkd-wait-online.service - Wait for Network to be Online. Sep 3 18:37:47.644966 systemd[1]: Reached target network-online.target - Network is Online. Sep 3 18:37:47.643000 audit[1]: SERVICE_START pid=1 uid=0 auid=4294967295 ses=4294967295 subj=system_u:system_r:kernel_t:s0 msg='unit=systemd-networkd-wait-online comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Sep 3 18:37:47.662400 kernel: audit: type=1130 audit(1788460667.643:160): pid=1 uid=0 auid=4294967295 ses=4294967295 subj=system_u:system_r:kernel_t:s0 msg='unit=systemd-networkd-wait-online comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Sep 3 18:37:47.696321 systemd[1]: Finished systemd-fsck@dev-disk-by\x2dlabel-OEM.service - File System Check on /dev/disk/by-label/OEM. Sep 3 18:37:47.700000 audit[1]: SERVICE_START pid=1 uid=0 auid=4294967295 ses=4294967295 subj=system_u:system_r:kernel_t:s0 msg='unit=systemd-fsck@dev-disk-by\x2dlabel-OEM comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Sep 3 18:37:47.716444 kernel: audit: type=1130 audit(1788460667.700:161): pid=1 uid=0 auid=4294967295 ses=4294967295 subj=system_u:system_r:kernel_t:s0 msg='unit=systemd-fsck@dev-disk-by\x2dlabel-OEM comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Sep 3 18:37:49.708386 kernel: erofs: (device dm-5): mounted with root inode @ nid 39. Sep 3 18:37:49.733389 kernel: loop4: detected capacity change from 0 to 388472 Sep 3 18:37:49.736547 kernel: loop4: p1 p2 p3 Sep 3 18:37:49.805699 kernel: device-mapper: verity: sha256 using shash "sha256-ce" Sep 3 18:37:49.805809 kernel: device-mapper: verity: Unrecognized verity feature request: root_hash_sig_key_desc Sep 3 18:37:49.810832 kernel: device-mapper: table: 254:5: verity: Unrecognized verity feature request (-EINVAL) Sep 3 18:37:49.814247 kernel: device-mapper: ioctl: error adding target to table Sep 3 18:37:49.814394 systemd-sysext[1990]: device-mapper: reload ioctl on loop4p1-72-verity (254:5) failed: Invalid argument Sep 3 18:37:49.821396 kernel: device-mapper: verity: sha256 using shash "sha256-ce" Sep 3 18:37:50.094443 kernel: erofs: (device dm-5): mounted with root inode @ nid 39. Sep 3 18:37:50.167386 kernel: loop4: detected capacity change from 0 to 158496 Sep 3 18:37:50.170393 kernel: loop4: p1 p2 p3 Sep 3 18:37:50.183543 kernel: device-mapper: verity: sha256 using shash "sha256-ce" Sep 3 18:37:50.183642 kernel: device-mapper: verity: Unrecognized verity feature request: root_hash_sig_key_desc Sep 3 18:37:50.183666 kernel: device-mapper: table: 254:5: verity: Unrecognized verity feature request (-EINVAL) Sep 3 18:37:50.191576 kernel: device-mapper: ioctl: error adding target to table Sep 3 18:37:50.191833 (sd-merge)[2059]: device-mapper: reload ioctl on loop4p1-77-verity (254:5) failed: Invalid argument Sep 3 18:37:50.202402 kernel: device-mapper: verity: sha256 using shash "sha256-ce" Sep 3 18:37:50.502264 kernel: erofs: (device dm-5): mounted with root inode @ nid 39. Sep 3 18:37:50.502400 kernel: loop5: detected capacity change from 0 to 140928 Sep 3 18:37:50.507261 kernel: loop5: p1 p2 p3 Sep 3 18:37:50.519114 kernel: device-mapper: verity: sha256 using shash "sha256-ce" Sep 3 18:37:50.519208 kernel: device-mapper: verity: Unrecognized verity feature request: root_hash_sig_key_desc Sep 3 18:37:50.519383 kernel: device-mapper: table: 254:6: verity: Unrecognized verity feature request (-EINVAL) Sep 3 18:37:50.527184 kernel: device-mapper: ioctl: error adding target to table Sep 3 18:37:50.527449 (sd-merge)[2059]: device-mapper: reload ioctl on loop5p1-81-verity (254:6) failed: Invalid argument Sep 3 18:37:50.534776 kernel: device-mapper: verity: sha256 using shash "sha256-ce" Sep 3 18:37:50.750416 kernel: erofs: (device dm-6): mounted with root inode @ nid 39. Sep 3 18:37:50.756515 kernel: loop6: detected capacity change from 0 to 388472 Sep 3 18:37:50.761392 kernel: loop6: p1 p2 p3 Sep 3 18:37:50.852406 kernel: device-mapper: verity: sha256 using shash "sha256-ce" Sep 3 18:37:50.852520 kernel: device-mapper: verity: Unrecognized verity feature request: root_hash_sig_key_desc Sep 3 18:37:50.857201 kernel: device-mapper: table: 254:7: verity: Unrecognized verity feature request (-EINVAL) Sep 3 18:37:50.860417 kernel: device-mapper: ioctl: error adding target to table Sep 3 18:37:50.860658 (sd-merge)[2059]: device-mapper: reload ioctl on loop6p1-85-verity (254:7) failed: Invalid argument Sep 3 18:37:50.869404 kernel: device-mapper: verity: sha256 using shash "sha256-ce" Sep 3 18:37:51.345387 kernel: erofs: (device dm-7): mounted with root inode @ nid 39. Sep 3 18:37:51.480698 (sd-merge)[2059]: Skipping extension refresh because no change was found, use --always-refresh=yes to always do a refresh. Sep 3 18:37:51.488000 audit[1]: SERVICE_START pid=1 uid=0 auid=4294967295 ses=4294967295 subj=system_u:system_r:kernel_t:s0 msg='unit=systemd-sysext comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Sep 3 18:37:51.639544 kernel: audit: type=1130 audit(1788460671.488:162): pid=1 uid=0 auid=4294967295 ses=4294967295 subj=system_u:system_r:kernel_t:s0 msg='unit=systemd-sysext comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Sep 3 18:37:51.483800 systemd[1]: Finished systemd-sysext.service - Merge System Extension Images into /usr/ and /opt/. Sep 3 18:37:51.492518 systemd[1]: Starting systemd-tmpfiles-setup.service - Create System Files and Directories... Sep 3 18:37:51.528346 systemd-tmpfiles[2082]: /usr/lib/tmpfiles.d/nfs-utils.conf:6: Duplicate line for path "/var/lib/nfs/sm", ignoring. Sep 3 18:37:51.528385 systemd-tmpfiles[2082]: /usr/lib/tmpfiles.d/nfs-utils.conf:7: Duplicate line for path "/var/lib/nfs/sm.bak", ignoring. Sep 3 18:37:51.528556 systemd-tmpfiles[2082]: /usr/lib/tmpfiles.d/provision.conf:20: Duplicate line for path "/root", ignoring. Sep 3 18:37:51.529171 systemd-tmpfiles[2082]: ACLs are not supported, ignoring. Sep 3 18:37:51.529200 systemd-tmpfiles[2082]: ACLs are not supported, ignoring. Sep 3 18:37:51.651963 systemd-tmpfiles[2082]: Detected autofs mount point '/boot' during canonicalization of 'boot'. Sep 3 18:37:51.651977 systemd-tmpfiles[2082]: Skipping /boot Sep 3 18:37:51.656873 systemd-tmpfiles[2082]: Detected autofs mount point '/boot' during canonicalization of 'boot'. Sep 3 18:37:51.656891 systemd-tmpfiles[2082]: Skipping /boot Sep 3 18:37:51.664992 systemd[1]: Finished systemd-tmpfiles-setup.service - Create System Files and Directories. Sep 3 18:37:51.669000 audit[1]: SERVICE_START pid=1 uid=0 auid=4294967295 ses=4294967295 subj=system_u:system_r:kernel_t:s0 msg='unit=systemd-tmpfiles-setup comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Sep 3 18:37:51.680963 systemd[1]: Starting audit-rules.service - Load Audit Rules... Sep 3 18:37:51.688257 kernel: audit: type=1130 audit(1788460671.669:163): pid=1 uid=0 auid=4294967295 ses=4294967295 subj=system_u:system_r:kernel_t:s0 msg='unit=systemd-tmpfiles-setup comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Sep 3 18:37:51.690198 systemd-vconsole-setup[1956]: Configuration of first virtual console was skipped, ignoring remaining ones. Sep 3 18:37:51.696321 systemd[1]: Starting clean-ca-certificates.service - Clean up broken links in /etc/ssl/certs... Sep 3 18:37:51.731000 audit[2091]: AUDIT1127 pid=2091 uid=0 auid=4294967295 ses=4294967295 subj=system_u:system_r:kernel_t:s0 msg=' comm="systemd-update-utmp" exe="/usr/lib/systemd/systemd-update-utmp" hostname=? addr=? terminal=? res=success' Sep 3 18:37:51.749000 audit[1]: SERVICE_START pid=1 uid=0 auid=4294967295 ses=4294967295 subj=system_u:system_r:kernel_t:s0 msg='unit=systemd-vconsole-setup comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Sep 3 18:37:51.704129 systemd[1]: Starting ldconfig.service - Rebuild Dynamic Linker Cache... Sep 3 18:37:51.768000 audit[1]: SERVICE_START pid=1 uid=0 auid=4294967295 ses=4294967295 subj=system_u:system_r:kernel_t:s0 msg='unit=systemd-update-utmp comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Sep 3 18:37:51.786632 kernel: audit: type=1127 audit(1788460671.731:164): pid=2091 uid=0 auid=4294967295 ses=4294967295 subj=system_u:system_r:kernel_t:s0 msg=' comm="systemd-update-utmp" exe="/usr/lib/systemd/systemd-update-utmp" hostname=? addr=? terminal=? res=success' Sep 3 18:37:51.710535 systemd[1]: Starting systemd-journal-catalog-update.service - Rebuild Journal Catalog... Sep 3 18:37:51.786851 kernel: audit: type=1130 audit(1788460671.749:165): pid=1 uid=0 auid=4294967295 ses=4294967295 subj=system_u:system_r:kernel_t:s0 msg='unit=systemd-vconsole-setup comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Sep 3 18:37:51.724557 systemd[1]: Starting systemd-update-utmp.service - Record System Boot/Shutdown in UTMP... Sep 3 18:37:51.786957 kernel: audit: type=1130 audit(1788460671.768:166): pid=1 uid=0 auid=4294967295 ses=4294967295 subj=system_u:system_r:kernel_t:s0 msg='unit=systemd-update-utmp comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Sep 3 18:37:51.732453 systemd[1]: Finished systemd-vconsole-setup.service - Virtual Console Setup. Sep 3 18:37:51.764665 systemd[1]: Finished systemd-update-utmp.service - Record System Boot/Shutdown in UTMP. Sep 3 18:37:52.699127 systemd[1]: Finished systemd-journal-catalog-update.service - Rebuild Journal Catalog. Sep 3 18:37:52.704000 audit[1]: SERVICE_START pid=1 uid=0 auid=4294967295 ses=4294967295 subj=system_u:system_r:kernel_t:s0 msg='unit=systemd-journal-catalog-update comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Sep 3 18:37:52.720383 kernel: audit: type=1130 audit(1788460672.704:167): pid=1 uid=0 auid=4294967295 ses=4294967295 subj=system_u:system_r:kernel_t:s0 msg='unit=systemd-journal-catalog-update comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Sep 3 18:37:53.709000 audit: CONFIG_CHANGE auid=4294967295 ses=4294967295 subj=system_u:system_r:kernel_t:s0 op=add_rule key=(null) list=5 res=1 Sep 3 18:37:53.710750 augenrules[2114]: No rules Sep 3 18:37:53.719291 systemd[1]: audit-rules.service: Deactivated successfully. Sep 3 18:37:53.709000 audit[2114]: SYSCALL arch=c00000b7 syscall=206 success=yes exit=1056 a0=3 a1=ffffed8cd450 a2=420 a3=0 items=0 ppid=2087 pid=2114 auid=4294967295 uid=0 gid=0 euid=0 suid=0 fsuid=0 egid=0 sgid=0 fsgid=0 tty=(none) ses=4294967295 comm="auditctl" exe="/usr/bin/auditctl" subj=system_u:system_r:kernel_t:s0 key=(null) Sep 3 18:37:53.720693 systemd[1]: Finished audit-rules.service - Load Audit Rules. Sep 3 18:37:53.736231 kernel: audit: type=1305 audit(1788460673.709:168): auid=4294967295 ses=4294967295 subj=system_u:system_r:kernel_t:s0 op=add_rule key=(null) list=5 res=1 Sep 3 18:37:53.736289 kernel: audit: type=1300 audit(1788460673.709:168): arch=c00000b7 syscall=206 success=yes exit=1056 a0=3 a1=ffffed8cd450 a2=420 a3=0 items=0 ppid=2087 pid=2114 auid=4294967295 uid=0 gid=0 euid=0 suid=0 fsuid=0 egid=0 sgid=0 fsgid=0 tty=(none) ses=4294967295 comm="auditctl" exe="/usr/bin/auditctl" subj=system_u:system_r:kernel_t:s0 key=(null) Sep 3 18:37:53.709000 audit: PROCTITLE proctitle=2F7362696E2F617564697463746C002D52002F6574632F61756469742F61756469742E72756C6573 Sep 3 18:37:53.748202 kernel: audit: type=1327 audit(1788460673.709:168): proctitle=2F7362696E2F617564697463746C002D52002F6574632F61756469742F61756469742E72756C6573 Sep 3 18:37:56.255335 systemd[1]: Finished clean-ca-certificates.service - Clean up broken links in /etc/ssl/certs. Sep 3 18:37:56.261996 systemd[1]: update-ca-certificates.service - Update CA bundle at /etc/ssl/certs/ca-certificates.crt skipped, unmet condition check ConditionPathIsSymbolicLink=!/etc/ssl/certs/ca-certificates.crt Sep 3 18:37:57.387733 systemd[1]: etc-machine\x2did.mount: Deactivated successfully. Sep 3 18:37:57.388437 systemd[1]: Finished systemd-machine-id-commit.service - Save Transient machine-id to Disk. Sep 3 18:38:09.415342 ldconfig[2089]: ldconfig: /usr/lib/ld.so.conf is not an ELF file - it has the wrong magic bytes at the start. Sep 3 18:38:09.449650 systemd[1]: Finished ldconfig.service - Rebuild Dynamic Linker Cache. Sep 3 18:38:09.456797 systemd[1]: Starting systemd-update-done.service - Update is Completed... Sep 3 18:38:09.654472 systemd[1]: Finished systemd-update-done.service - Update is Completed. Sep 3 18:38:09.659320 systemd[1]: Reached target sysinit.target - System Initialization. Sep 3 18:38:09.663974 systemd[1]: Started motdgen.path - Watch for update engine configuration changes. Sep 3 18:38:09.668982 systemd[1]: Started user-cloudinit@var-lib-flatcar\x2dinstall-user_data.path - Watch for a cloud-config at /var/lib/flatcar-install/user_data. Sep 3 18:38:09.674138 systemd[1]: Started logrotate.timer - Daily rotation of log files. Sep 3 18:38:09.679065 systemd[1]: Started mdadm.timer - Weekly check for MD array's redundancy information.. Sep 3 18:38:09.684195 systemd[1]: Started systemd-sysupdate-reboot.timer - Reboot Automatically After System Update. Sep 3 18:38:09.689244 systemd[1]: Started systemd-sysupdate.timer - Automatic System Update. Sep 3 18:38:09.693938 systemd[1]: Started systemd-tmpfiles-clean.timer - Daily Cleanup of Temporary Directories. Sep 3 18:38:09.699191 systemd[1]: update-engine-stub.timer - Update Engine Stub Timer skipped, unmet condition check ConditionPathExists=/usr/.noupdate Sep 3 18:38:09.699222 systemd[1]: Reached target paths.target - Path Units. Sep 3 18:38:09.702800 systemd[1]: Reached target timers.target - Timer Units. Sep 3 18:38:09.709518 systemd[1]: Listening on dbus.socket - D-Bus System Message Bus Socket. Sep 3 18:38:09.715562 systemd[1]: Starting docker.socket - Docker Socket for the API... Sep 3 18:38:09.720871 systemd[1]: Listening on sshd-unix-local.socket - OpenSSH Server Socket (systemd-ssh-generator, AF_UNIX Local). Sep 3 18:38:09.727790 systemd[1]: Listening on sshd.socket - OpenSSH Server Socket. Sep 3 18:38:09.732527 systemd[1]: Listening on systemd-hostnamed.socket - Hostname Service Socket. Sep 3 18:38:09.737455 systemd[1]: Listening on systemd-logind-varlink.socket - User Login Management Varlink Socket. Sep 3 18:38:09.743478 systemd[1]: Listening on systemd-machined.socket - Virtual Machine and Container Registration Service Socket. Sep 3 18:38:09.749242 systemd[1]: Listening on docker.socket - Docker Socket for the API. Sep 3 18:38:09.753687 systemd[1]: Reached target sockets.target - Socket Units. Sep 3 18:38:09.757750 systemd[1]: Reached target basic.target - Basic System. Sep 3 18:38:09.761561 systemd[1]: addon-config@oem.service - Configure Addon /oem skipped, no trigger condition checks were met. Sep 3 18:38:09.761587 systemd[1]: addon-run@oem.service - Run Addon /oem skipped, no trigger condition checks were met. Sep 3 18:38:09.763202 systemd[1]: Starting chronyd.service - NTP client/server... Sep 3 18:38:09.777487 systemd[1]: Starting containerd.service - containerd container runtime... Sep 3 18:38:09.782343 systemd[1]: Starting dbus.service - D-Bus System Message Bus... Sep 3 18:38:09.790920 systemd[1]: Starting dracut-shutdown.service - Restore /run/initramfs on shutdown... Sep 3 18:38:09.799482 systemd[1]: Starting enable-oem-cloudinit.service - Enable cloudinit... Sep 3 18:38:09.806549 systemd[1]: Starting extend-filesystems.service - Extend Filesystems... Sep 3 18:38:09.812660 systemd[1]: flatcar-setup-environment.service - Modifies /etc/environment for CoreOS skipped, unmet condition check ConditionPathExists=/oem/bin/flatcar-setup-environment Sep 3 18:38:09.813862 systemd[1]: Started hv_kvp_daemon.service - Hyper-V KVP daemon. Sep 3 18:38:09.815843 chronyd[2127]: chronyd version 4.8 starting (+CMDMON +REFCLOCK +RTC +PRIVDROP +SCFILTER -SIGND +NTS +SECHASH +IPV6 -DEBUG) Sep 3 18:38:09.818115 systemd[1]: hv_vss_daemon.service - Hyper-V VSS daemon skipped, unmet condition check ConditionPathExists=/dev/vmbus/hv_vss Sep 3 18:38:09.826492 systemd[1]: Starting motdgen.service - Generate /run/flatcar/motd... Sep 3 18:38:09.829264 KVP[2133]: KVP starting; pid is:2133 Sep 3 18:38:09.832515 systemd[1]: Starting nvidia.service - NVIDIA Configure Service... Sep 3 18:38:09.839834 systemd[1]: Starting ssh-key-proc-cmdline.service - Install an ssh key from /proc/cmdline... Sep 3 18:38:09.846695 KVP[2133]: KVP LIC Version: 3.1 Sep 3 18:38:09.847085 jq[2131]: true Sep 3 18:38:09.847514 kernel: hv_utils: KVP IC version 4.0 Sep 3 18:38:09.847703 chronyd[2127]: Timezone right/UTC failed leap second check, ignoring Sep 3 18:38:09.847840 chronyd[2127]: Loaded seccomp filter (level 2) Sep 3 18:38:09.849617 systemd[1]: Starting sshd-keygen.service - Generate sshd host keys... Sep 3 18:38:09.858269 systemd[1]: Starting systemd-logind.service - User Login Management... Sep 3 18:38:09.864464 systemd[1]: tcsd.service - TCG Core Services Daemon skipped, unmet condition check ConditionPathExists=/dev/tpm0 Sep 3 18:38:09.865152 systemd[1]: Starting update-engine.service - Update Engine... Sep 3 18:38:09.870379 systemd[1]: Starting update-ssh-keys-after-ignition.service - Run update-ssh-keys once after Ignition... Sep 3 18:38:09.877703 systemd[1]: Started chronyd.service - NTP client/server. Sep 3 18:38:09.879735 jq[2147]: false Sep 3 18:38:09.884994 systemd[1]: Finished dracut-shutdown.service - Restore /run/initramfs on shutdown. Sep 3 18:38:09.893620 systemd[1]: ssh-key-proc-cmdline.service: Deactivated successfully. Sep 3 18:38:09.895516 systemd[1]: Finished ssh-key-proc-cmdline.service - Install an ssh key from /proc/cmdline. Sep 3 18:38:09.902276 systemd[1]: update-ssh-keys-after-ignition.service: Skipped due to 'exec-condition'. Sep 3 18:38:09.902588 systemd[1]: Condition check resulted in update-ssh-keys-after-ignition.service - Run update-ssh-keys once after Ignition being skipped. Sep 3 18:38:09.906106 jq[2154]: true Sep 3 18:38:09.906133 systemd[1]: sshkeys.service skipped, no trigger condition checks were met. Sep 3 18:38:09.919454 systemctl[2162]: Created symlink '/etc/systemd/system/multi-user.target.wants/oem-cloudinit.service' → '/usr/lib/systemd/system/oem-cloudinit.service'. Sep 3 18:38:09.919581 systemd[1]: Reload requested from client PID 2162 ('systemctl') (unit enable-oem-cloudinit.service)... Sep 3 18:38:09.919588 systemd[1]: Reloading... Sep 3 18:38:09.980274 zram_generator::config[2207]: No configuration found. Sep 3 18:38:10.153716 extend-filesystems[2132]: Found /dev/sda6 Sep 3 18:38:10.159343 systemd-logind[2142]: New seat seat0. Sep 3 18:38:10.160855 systemd-logind[2142]: Watching system buttons on /dev/input/event1 (AT Translated Set 2 keyboard) Sep 3 18:38:10.164917 motdgen[2269]: /oem/oem-release: line 2: Azure: command not found Sep 3 18:38:10.167112 update_engine[2143]: I20260903 18:38:10.166827 2143 main.cc:92] Flatcar Update Engine starting Sep 3 18:38:10.171068 extend-filesystems[2132]: Found /dev/sda9 Sep 3 18:38:10.179618 extend-filesystems[2132]: Checking size of /dev/sda9 Sep 3 18:38:10.235405 systemd[1]: Reloading finished in 315 ms. Sep 3 18:38:10.252338 systemd[1]: Started systemd-logind.service - User Login Management. Sep 3 18:38:10.257385 systemd[1]: motdgen.service: Deactivated successfully. Sep 3 18:38:10.257584 systemd[1]: Finished motdgen.service - Generate /run/flatcar/motd. Sep 3 18:38:10.286354 systemd[1]: Created slice system-sshd.slice - Slice /system/sshd. Sep 3 18:38:10.294565 systemd[1]: Starting oem-cloudinit.service - Run cloudinit... Sep 3 18:38:10.320706 bash[2298]: + case azure in Sep 3 18:38:10.320706 bash[2298]: + true Sep 3 18:38:10.340152 sshd_keygen[2266]: ssh-keygen: generating new host keys: RSA ECDSA ED25519 MLDSA44-ED25519 Sep 3 18:38:10.341228 bash[2302]: ++ case azure in Sep 3 18:38:10.341228 bash[2302]: ++ printf /bin/bash azure Sep 3 18:38:10.341355 bash[2300]: + exec coreos-cloudinit --oem=/bin/bash Sep 3 18:38:10.359805 systemd[1]: Finished sshd-keygen.service - Generate sshd host keys. Sep 3 18:38:10.366504 systemd[1]: Starting issuegen.service - Generate /run/issue... Sep 3 18:38:10.375640 systemd[1]: Started sshd@0-1-10.0.0.4:22-217.60.255.130:43890.service - OpenSSH per-connection server daemon (217.60.255.130:43890). Sep 3 18:38:10.383560 systemd[1]: Starting waagent.service - Microsoft Azure Linux Agent... Sep 3 18:38:10.389120 systemd[1]: issuegen.service: Deactivated successfully. Sep 3 18:38:10.391520 systemd[1]: Finished issuegen.service - Generate /run/issue. Sep 3 18:38:10.401432 systemd[1]: Starting systemd-user-sessions.service - Permit User Sessions... Sep 3 18:38:10.410533 systemd[1]: Started waagent.service - Microsoft Azure Linux Agent. Sep 3 18:38:10.421872 systemd[1]: Finished systemd-user-sessions.service - Permit User Sessions. Sep 3 18:38:10.429226 systemd[1]: Started getty@tty1.service - Getty on tty1. Sep 3 18:38:10.434451 systemd[1]: Started serial-getty@ttyAMA0.service - Serial Getty on ttyAMA0. Sep 3 18:38:10.439764 systemd[1]: Reached target getty.target - Login Prompts. Sep 3 18:38:10.489638 extend-filesystems[2132]: Resized partition /dev/sda9 Sep 3 18:38:10.503743 systemd[1]: Finished nvidia.service - NVIDIA Configure Service. Sep 3 18:38:10.545770 extend-filesystems[2331]: resize2fs 1.47.4 (6-Mar-2025) Sep 3 18:38:10.554386 kernel: EXT4-fs (sda9): resizing filesystem from 6359552 to 6376955 blocks Sep 3 18:38:10.560429 kernel: EXT4-fs (sda9): resized filesystem to 6376955 Sep 3 18:38:10.817583 systemd[1]: oem-cloudinit.service: Main process exited, code=exited, status=2/INVALIDARGUMENT Sep 3 18:38:10.843017 bash[2300]: Invalid option to -oem: "/bin/bash". Supported options: ["ec2-compat" "gce" "azure" "cloudsigma" "vmware" "digitalocean"] Sep 3 18:38:10.817676 systemd[1]: oem-cloudinit.service: Failed with result 'exit-code'. Sep 3 18:38:10.818057 systemd[1]: Failed to start oem-cloudinit.service - Run cloudinit. Sep 3 18:38:10.826575 systemctl[2162]: Job for oem-cloudinit.service failed because the control process exited with error code. Sep 3 18:38:10.826578 systemctl[2162]: See "systemctl status oem-cloudinit.service" and "journalctl -xeu oem-cloudinit.service" for details. Sep 3 18:38:10.827605 systemd[1]: enable-oem-cloudinit.service: Main process exited, code=exited, status=1/FAILURE Sep 3 18:38:10.827676 systemd[1]: enable-oem-cloudinit.service: Failed with result 'exit-code'. Sep 3 18:38:10.827912 systemd[1]: Failed to start enable-oem-cloudinit.service - Enable cloudinit. Sep 3 18:38:11.192026 extend-filesystems[2331]: Filesystem at /dev/sda9 is mounted on /; on-line resizing required Sep 3 18:38:11.192026 extend-filesystems[2331]: old_desc_blocks = 4, new_desc_blocks = 4 Sep 3 18:38:11.192026 extend-filesystems[2331]: The filesystem on /dev/sda9 is now 6376955 (4k) blocks long. Sep 3 18:38:11.213100 extend-filesystems[2132]: Resized filesystem in /dev/sda9 Sep 3 18:38:11.193496 systemd[1]: extend-filesystems.service: Deactivated successfully. Sep 3 18:38:11.193821 systemd[1]: Finished extend-filesystems.service - Extend Filesystems. Sep 3 18:38:11.241428 dbus-daemon[2129]: [system] SELinux support is enabled Sep 3 18:38:11.242553 systemd[1]: Started dbus.service - D-Bus System Message Bus. Sep 3 18:38:11.246911 update_engine[2143]: I20260903 18:38:11.246534 2143 update_check_scheduler.cc:74] Next update check in 6m5s Sep 3 18:38:11.253457 dbus-daemon[2129]: [system] Successfully activated service 'org.freedesktop.systemd1' Sep 3 18:38:11.253983 systemd[1]: Started update-engine.service - Update Engine. Sep 3 18:38:11.258591 systemd[1]: system-cloudinit@usr-share-coreos-cloud\x2dconfig.yml.service - Load cloud-config from /usr/share/coreos/cloud-config.yml skipped, unmet condition check ConditionFileNotEmpty=/usr/share/coreos/cloud-config.yml Sep 3 18:38:11.258824 systemd[1]: Reached target system-config.target - Load system-provided cloud configs. Sep 3 18:38:11.264963 systemd[1]: user-cloudinit-proc-cmdline.service - Load cloud-config from url defined in /proc/cmdline skipped, unmet condition check ConditionKernelCommandLine=cloud-config-url Sep 3 18:38:11.265183 systemd[1]: Reached target user-config.target - Load user-provided cloud configs. Sep 3 18:38:11.271703 systemd[1]: Started locksmithd.service - Cluster reboot manager. Sep 3 18:38:12.400652 locksmithd[2403]: locksmithd starting currentOperation="UPDATE_STATUS_IDLE" strategy="reboot" Sep 3 18:38:12.401959 sshd[2312]: Invalid user admin from 217.60.255.130 port 43890 Sep 3 18:38:13.647163 sshd[2312]: Received disconnect from 217.60.255.130 port 43890:11: Bye Bye [preauth] Sep 3 18:38:13.647163 sshd[2312]: Disconnected from invalid user admin 217.60.255.130 port 43890 [preauth] Sep 3 18:38:13.648692 systemd[1]: sshd@0-1-10.0.0.4:22-217.60.255.130:43890.service: Deactivated successfully. Sep 3 18:38:16.544882 login[2326]: pam_unix(login:session): session opened for user core(uid=500) by core(uid=0) Sep 3 18:38:16.545533 login[2327]: pam_unix(login:session): session opened for user core(uid=500) by core(uid=0) Sep 3 18:38:16.553434 systemd-logind[2142]: New session '1' of user 'core' with class 'user-light' and type 'tty'. Sep 3 18:38:16.555222 systemd[1]: Created slice user-500.slice - User Slice of UID 500. Sep 3 18:38:16.556513 systemd[1]: Starting user-runtime-dir@500.service - User Runtime Directory /run/user/500... Sep 3 18:38:16.560163 systemd-logind[2142]: New session '2' of user 'core' with class 'user-light' and type 'tty'. Sep 3 18:38:16.710160 systemd[1]: Finished user-runtime-dir@500.service - User Runtime Directory /run/user/500. Sep 3 18:38:16.714676 systemd[1]: Started session-1.scope - Session 1 of User core. Sep 3 18:38:16.715557 systemd[1]: Started session-2.scope - Session 2 of User core. Sep 3 18:38:18.680274 containerd[2294]: time="2026-09-03T18:38:18Z" 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 Sep 3 18:38:18.681376 containerd[2294]: time="2026-09-03T18:38:18Z" level=warning msg="Configuration migrated from version 2, use `containerd config migrate` to avoid migration" t="19.288µs" Sep 3 18:38:18.681846 containerd[2294]: time="2026-09-03T18:38:18.681759504Z" level=info msg="starting containerd" revision=aad11006b869517fcd3009450b6f82da282e1a9b version=v2.3.3 Sep 3 18:38:18.682910 containerd[2294]: time="2026-09-03T18:38:18.682141592Z" level=info msg="loading plugin" id=io.containerd.content.v1.content type=io.containerd.content.v1 Sep 3 18:38:18.682910 containerd[2294]: time="2026-09-03T18:38:18.682304880Z" level=warning msg="failed check for fsverity support" error="enable fsverity failed: operation not supported" path=/var/lib/containerd/io.containerd.content.v1.content Sep 3 18:38:18.682910 containerd[2294]: time="2026-09-03T18:38:18.682318488Z" level=info msg="loading plugin" id=io.containerd.image-verifier.v1.bindir type=io.containerd.image-verifier.v1 Sep 3 18:38:18.682910 containerd[2294]: time="2026-09-03T18:38:18.682325864Z" level=info msg="loading plugin" id=io.containerd.internal.v1.opt type=io.containerd.internal.v1 Sep 3 18:38:18.682910 containerd[2294]: time="2026-09-03T18:38:18.682440584Z" level=info msg="loading plugin" id=io.containerd.warning.v1.deprecations type=io.containerd.warning.v1 Sep 3 18:38:18.683045 containerd[2294]: time="2026-09-03T18:38:18.682450440Z" level=info msg="loading plugin" id=io.containerd.event.v1.exchange type=io.containerd.event.v1 Sep 3 18:38:18.683124 containerd[2294]: time="2026-09-03T18:38:18.683108000Z" level=info msg="loading plugin" id=io.containerd.mount-handler.v1.erofs type=io.containerd.mount-handler.v1 Sep 3 18:38:18.683178 containerd[2294]: time="2026-09-03T18:38:18.683166632Z" level=info msg="loading plugin" id=io.containerd.snapshotter.v1.blockfile type=io.containerd.snapshotter.v1 Sep 3 18:38:18.683296 containerd[2294]: time="2026-09-03T18:38:18.683279712Z" level=info msg="skip loading plugin" error="no scratch file generator: skip plugin" id=io.containerd.snapshotter.v1.blockfile type=io.containerd.snapshotter.v1 Sep 3 18:38:18.683351 containerd[2294]: time="2026-09-03T18:38:18.683340288Z" level=info msg="loading plugin" id=io.containerd.snapshotter.v1.btrfs type=io.containerd.snapshotter.v1 Sep 3 18:38:18.683612 containerd[2294]: time="2026-09-03T18:38:18.683589640Z" 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 Sep 3 18:38:18.684127 containerd[2294]: time="2026-09-03T18:38:18.683658824Z" level=info msg="loading plugin" id=io.containerd.snapshotter.v1.devmapper type=io.containerd.snapshotter.v1 Sep 3 18:38:18.684127 containerd[2294]: time="2026-09-03T18:38:18.683677720Z" level=info msg="skip loading plugin" error="devmapper not configured: skip plugin" id=io.containerd.snapshotter.v1.devmapper type=io.containerd.snapshotter.v1 Sep 3 18:38:18.684127 containerd[2294]: time="2026-09-03T18:38:18.683685384Z" level=info msg="loading plugin" id=io.containerd.snapshotter.v1.erofs type=io.containerd.snapshotter.v1 Sep 3 18:38:18.684127 containerd[2294]: time="2026-09-03T18:38:18.683850800Z" level=info msg="loading plugin" id=io.containerd.snapshotter.v1.native type=io.containerd.snapshotter.v1 Sep 3 18:38:18.684127 containerd[2294]: time="2026-09-03T18:38:18.683894640Z" level=info msg="loading plugin" id=io.containerd.snapshotter.v1.overlayfs type=io.containerd.snapshotter.v1 Sep 3 18:38:18.684127 containerd[2294]: time="2026-09-03T18:38:18.684010072Z" level=info msg="loading plugin" id=io.containerd.snapshotter.v1.zfs type=io.containerd.snapshotter.v1 Sep 3 18:38:18.684127 containerd[2294]: time="2026-09-03T18:38:18.684026960Z" 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 Sep 3 18:38:18.684127 containerd[2294]: time="2026-09-03T18:38:18.684039088Z" level=info msg="loading plugin" id=io.containerd.monitor.task.v1.cgroups type=io.containerd.monitor.task.v1 Sep 3 18:38:18.685079 containerd[2294]: time="2026-09-03T18:38:18.684536536Z" level=info msg="loading plugin" id=io.containerd.metadata.v1.bolt type=io.containerd.metadata.v1 Sep 3 18:38:18.685219 containerd[2294]: time="2026-09-03T18:38:18.685200624Z" level=info msg="metadata content store policy set" policy=shared Sep 3 18:38:18.699133 containerd[2294]: time="2026-09-03T18:38:18.699094376Z" level=info msg="loading plugin" id=io.containerd.gc.v1.scheduler type=io.containerd.gc.v1 Sep 3 18:38:18.699278 containerd[2294]: time="2026-09-03T18:38:18.699261568Z" level=info msg="loading plugin" id=io.containerd.server.v1.metrics type=io.containerd.server.v1 Sep 3 18:38:18.699337 containerd[2294]: time="2026-09-03T18:38:18.699325088Z" level=info msg="skip loading plugin" error="skip plugin" id=io.containerd.server.v1.metrics type=io.containerd.server.v1 Sep 3 18:38:18.699407 containerd[2294]: time="2026-09-03T18:38:18.699391808Z" level=info msg="loading plugin" id=io.containerd.tracing.processor.v1.otlp type=io.containerd.tracing.processor.v1 Sep 3 18:38:18.699473 containerd[2294]: time="2026-09-03T18:38:18.699457816Z" 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 Sep 3 18:38:18.699515 containerd[2294]: time="2026-09-03T18:38:18.699502592Z" level=info msg="loading plugin" id=io.containerd.internal.v1.tracing type=io.containerd.internal.v1 Sep 3 18:38:18.699566 containerd[2294]: time="2026-09-03T18:38:18.699552776Z" level=info msg="skip loading plugin" error="skip plugin: tracing endpoint not configured" id=io.containerd.internal.v1.tracing type=io.containerd.internal.v1 Sep 3 18:38:18.699616 containerd[2294]: time="2026-09-03T18:38:18.699591456Z" level=info msg="loading plugin" id=io.containerd.nri.v1.nri type=io.containerd.nri.v1 Sep 3 18:38:18.700125 containerd[2294]: time="2026-09-03T18:38:18.700105256Z" level=info msg="built-in NRI default validator is disabled" Sep 3 18:38:18.700483 containerd[2294]: time="2026-09-03T18:38:18.700182280Z" level=info msg="runtime interface created" Sep 3 18:38:18.700483 containerd[2294]: time="2026-09-03T18:38:18.700193112Z" level=info msg="created NRI interface" Sep 3 18:38:18.700483 containerd[2294]: time="2026-09-03T18:38:18.700209880Z" level=info msg="loading plugin" id=io.containerd.ttrpc.v1.otelttrpc type=io.containerd.ttrpc.v1 Sep 3 18:38:18.700483 containerd[2294]: time="2026-09-03T18:38:18.700220008Z" level=info msg="loading plugin" id=io.containerd.service.v1.containers-service type=io.containerd.service.v1 Sep 3 18:38:18.700483 containerd[2294]: time="2026-09-03T18:38:18.700234032Z" level=info msg="loading plugin" id=io.containerd.service.v1.content-service type=io.containerd.service.v1 Sep 3 18:38:18.700483 containerd[2294]: time="2026-09-03T18:38:18.700245352Z" level=info msg="loading plugin" id=io.containerd.differ.v1.erofs type=io.containerd.differ.v1 Sep 3 18:38:18.714347 containerd[2294]: time="2026-09-03T18:38:18.714317288Z" level=info msg="loading plugin" id=io.containerd.mount-manager.v1.bolt type=io.containerd.mount-manager.v1 Sep 3 18:38:18.714648 containerd[2294]: time="2026-09-03T18:38:18.714626232Z" level=info msg="loading plugin" id=io.containerd.differ.v1.walking type=io.containerd.differ.v1 Sep 3 18:38:18.714719 containerd[2294]: time="2026-09-03T18:38:18.714706560Z" level=info msg="loading plugin" id=io.containerd.service.v1.diff-service type=io.containerd.service.v1 Sep 3 18:38:18.714790 containerd[2294]: time="2026-09-03T18:38:18.714776680Z" level=info msg="loading plugin" id=io.containerd.service.v1.images-service type=io.containerd.service.v1 Sep 3 18:38:18.714850 containerd[2294]: time="2026-09-03T18:38:18.714837080Z" level=info msg="loading plugin" id=io.containerd.service.v1.introspection-service type=io.containerd.service.v1 Sep 3 18:38:18.714900 containerd[2294]: time="2026-09-03T18:38:18.714888144Z" level=info msg="loading plugin" id=io.containerd.service.v1.namespaces-service type=io.containerd.service.v1 Sep 3 18:38:18.714945 containerd[2294]: time="2026-09-03T18:38:18.714934128Z" level=info msg="loading plugin" id=io.containerd.service.v1.snapshots-service type=io.containerd.service.v1 Sep 3 18:38:18.715017 containerd[2294]: time="2026-09-03T18:38:18.714998120Z" level=info msg="loading plugin" id=io.containerd.shim.v1.manager type=io.containerd.shim.v1 Sep 3 18:38:18.715074 containerd[2294]: time="2026-09-03T18:38:18.715062296Z" level=info msg="loading plugin" id=io.containerd.runtime.v2.task type=io.containerd.runtime.v2 Sep 3 18:38:18.715260 containerd[2294]: time="2026-09-03T18:38:18.715240944Z" level=info msg="loading plugin" id=io.containerd.service.v1.tasks-service type=io.containerd.service.v1 Sep 3 18:38:18.715326 containerd[2294]: time="2026-09-03T18:38:18.715313560Z" level=info msg="loading plugin" id=io.containerd.grpc.v1.containers type=io.containerd.grpc.v1 Sep 3 18:38:18.715401 containerd[2294]: time="2026-09-03T18:38:18.715357480Z" level=info msg="loading plugin" id=io.containerd.grpc.v1.content type=io.containerd.grpc.v1 Sep 3 18:38:18.715641 containerd[2294]: time="2026-09-03T18:38:18.715448792Z" level=info msg="loading plugin" id=io.containerd.grpc.v1.diff type=io.containerd.grpc.v1 Sep 3 18:38:18.715641 containerd[2294]: time="2026-09-03T18:38:18.715473208Z" level=info msg="loading plugin" id=io.containerd.grpc.v1.events type=io.containerd.grpc.v1 Sep 3 18:38:18.715641 containerd[2294]: time="2026-09-03T18:38:18.715481480Z" level=info msg="loading plugin" id=io.containerd.grpc.v1.images type=io.containerd.grpc.v1 Sep 3 18:38:18.715641 containerd[2294]: time="2026-09-03T18:38:18.715488432Z" level=info msg="loading plugin" id=io.containerd.grpc.v1.introspection type=io.containerd.grpc.v1 Sep 3 18:38:18.715641 containerd[2294]: time="2026-09-03T18:38:18.715493832Z" level=info msg="loading plugin" id=io.containerd.lease.v1.manager type=io.containerd.lease.v1 Sep 3 18:38:18.715641 containerd[2294]: time="2026-09-03T18:38:18.715500536Z" level=info msg="loading plugin" id=io.containerd.grpc.v1.leases type=io.containerd.grpc.v1 Sep 3 18:38:18.715641 containerd[2294]: time="2026-09-03T18:38:18.715506584Z" level=info msg="loading plugin" id=io.containerd.grpc.v1.mounts type=io.containerd.grpc.v1 Sep 3 18:38:18.715641 containerd[2294]: time="2026-09-03T18:38:18.715511352Z" level=info msg="loading plugin" id=io.containerd.grpc.v1.namespaces type=io.containerd.grpc.v1 Sep 3 18:38:18.715641 containerd[2294]: time="2026-09-03T18:38:18.715519176Z" level=info msg="loading plugin" id=io.containerd.sandbox.store.v1.local type=io.containerd.sandbox.store.v1 Sep 3 18:38:18.715641 containerd[2294]: time="2026-09-03T18:38:18.715524216Z" level=info msg="loading plugin" id=io.containerd.transfer.v1.local type=io.containerd.transfer.v1 Sep 3 18:38:18.715641 containerd[2294]: time="2026-09-03T18:38:18.715565488Z" level=info msg="loading plugin" id=io.containerd.cri.v1.images type=io.containerd.cri.v1 Sep 3 18:38:18.715940 containerd[2294]: time="2026-09-03T18:38:18.715883936Z" level=info msg="Get image filesystem path \"/var/lib/containerd/io.containerd.snapshotter.v1.overlayfs\" for snapshotter \"overlayfs\"" Sep 3 18:38:18.716002 containerd[2294]: time="2026-09-03T18:38:18.715989304Z" level=info msg="Start snapshots syncer" Sep 3 18:38:18.716065 containerd[2294]: time="2026-09-03T18:38:18.716050984Z" level=info msg="loading plugin" id=io.containerd.cri.v1.runtime type=io.containerd.cri.v1 Sep 3 18:38:18.716396 containerd[2294]: time="2026-09-03T18:38:18.716346240Z" 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,\"cgroupWritable\":false,\"baseRuntimeSpec\":\"\",\"cniConfDir\":\"\",\"cniMaxConfNum\":0,\"snapshotter\":\"\",\"sandboxer\":\"podsandbox\",\"io_type\":\"\"}},\"ignoreBlockIONotEnabledErrors\":false,\"ignoreRdtNotEnabledErrors\":false},\"cni\":{\"binDir\":\"\",\"binDirs\":[\"/opt/cni/bin\"],\"confDir\":\"/etc/cni/net.d\",\"maxConfNum\":1,\"setupSerially\":false,\"confTemplate\":\"\",\"ipPref\":\"\",\"useInternalLoopback\":false},\"enableSelinux\":true,\"selinuxCategoryRange\":1024,\"maxContainerLogLineSize\":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,\"statsCollectPeriod\":\"\",\"statsRetentionPeriod\":\"\",\"containerdRootDir\":\"/var/lib/containerd\",\"containerdEndpoint\":\"/run/containerd/containerd.sock\",\"rootDir\":\"/var/lib/containerd/io.containerd.grpc.v1.cri\",\"stateDir\":\"/run/containerd/io.containerd.grpc.v1.cri\"}" Sep 3 18:38:18.717143 containerd[2294]: time="2026-09-03T18:38:18.716497904Z" level=info msg="loading plugin" id=io.containerd.podsandbox.controller.v1.podsandbox type=io.containerd.podsandbox.controller.v1 Sep 3 18:38:18.717143 containerd[2294]: time="2026-09-03T18:38:18.716564536Z" level=info msg="loading plugin" id=io.containerd.sandbox.controller.v1.shim type=io.containerd.sandbox.controller.v1 Sep 3 18:38:18.717143 containerd[2294]: time="2026-09-03T18:38:18.716672784Z" level=info msg="loading plugin" id=io.containerd.grpc.v1.sandbox-controllers type=io.containerd.grpc.v1 Sep 3 18:38:18.717143 containerd[2294]: time="2026-09-03T18:38:18.716690200Z" level=info msg="loading plugin" id=io.containerd.grpc.v1.sandboxes type=io.containerd.grpc.v1 Sep 3 18:38:18.717143 containerd[2294]: time="2026-09-03T18:38:18.716695840Z" level=info msg="loading plugin" id=io.containerd.grpc.v1.snapshots type=io.containerd.grpc.v1 Sep 3 18:38:18.717143 containerd[2294]: time="2026-09-03T18:38:18.716701464Z" level=info msg="loading plugin" id=io.containerd.streaming.v1.manager type=io.containerd.streaming.v1 Sep 3 18:38:18.717143 containerd[2294]: time="2026-09-03T18:38:18.716708432Z" level=info msg="loading plugin" id=io.containerd.grpc.v1.streaming type=io.containerd.grpc.v1 Sep 3 18:38:18.717143 containerd[2294]: time="2026-09-03T18:38:18.716714008Z" level=info msg="loading plugin" id=io.containerd.grpc.v1.tasks type=io.containerd.grpc.v1 Sep 3 18:38:18.717143 containerd[2294]: time="2026-09-03T18:38:18.716718872Z" level=info msg="loading plugin" id=io.containerd.grpc.v1.transfer type=io.containerd.grpc.v1 Sep 3 18:38:18.717143 containerd[2294]: time="2026-09-03T18:38:18.716725784Z" level=info msg="loading plugin" id=io.containerd.grpc.v1.version type=io.containerd.grpc.v1 Sep 3 18:38:18.717143 containerd[2294]: time="2026-09-03T18:38:18.716730792Z" level=info msg="loading plugin" id=io.containerd.grpc.v1.healthcheck type=io.containerd.grpc.v1 Sep 3 18:38:18.717143 containerd[2294]: time="2026-09-03T18:38:18.716735880Z" level=info msg="loading plugin" id=io.containerd.grpc.v1.cri type=io.containerd.grpc.v1 Sep 3 18:38:18.717143 containerd[2294]: time="2026-09-03T18:38:18.716746416Z" level=info msg="Connect containerd service" Sep 3 18:38:18.717143 containerd[2294]: time="2026-09-03T18:38:18.716797984Z" level=info msg="using experimental NRI integration - disable nri plugin to prevent this" Sep 3 18:38:18.718043 containerd[2294]: time="2026-09-03T18:38:18.717931784Z" level=warning msg="failed to load cni during init, please check CRI plugin status before setting up network for pods" error="cni config load failed: no network config found in /etc/cni/net.d: cni plugin not initialized: failed to load cni config" Sep 3 18:38:21.459397 containerd[2294]: time="2026-09-03T18:38:21.458981808Z" level=info msg="loading plugin" id=io.containerd.server.v1.ttrpc type=io.containerd.server.v1 Sep 3 18:38:21.459397 containerd[2294]: time="2026-09-03T18:38:21.459071464Z" level=info msg="loading plugin" id=io.containerd.monitor.container.v1.restart type=io.containerd.monitor.container.v1 Sep 3 18:38:21.459397 containerd[2294]: time="2026-09-03T18:38:21.459107728Z" level=info msg="loading plugin" id=io.containerd.metrics.v1.grpc-prometheus type=io.containerd.metrics.v1 Sep 3 18:38:21.459397 containerd[2294]: time="2026-09-03T18:38:21.459148528Z" level=info msg="loading plugin" id=io.containerd.metrics.v1.grpc-otel type=io.containerd.metrics.v1 Sep 3 18:38:21.459397 containerd[2294]: time="2026-09-03T18:38:21.459175328Z" level=info msg="loading plugin" id=io.containerd.server.v1.grpc type=io.containerd.server.v1 Sep 3 18:38:21.459818 containerd[2294]: time="2026-09-03T18:38:21.459466104Z" level=info msg="Start subscribing containerd event" Sep 3 18:38:21.459818 containerd[2294]: time="2026-09-03T18:38:21.459521048Z" level=info msg="Start stats collector" Sep 3 18:38:21.459818 containerd[2294]: time="2026-09-03T18:38:21.459556224Z" level=info msg="Start recovering state" Sep 3 18:38:21.460532 containerd[2294]: time="2026-09-03T18:38:21.459922024Z" level=info msg="Start event monitor" Sep 3 18:38:21.460532 containerd[2294]: time="2026-09-03T18:38:21.459945248Z" level=info msg="Start cni network conf syncer for default" Sep 3 18:38:21.460532 containerd[2294]: time="2026-09-03T18:38:21.459950864Z" level=info msg="Start streaming server" Sep 3 18:38:21.460532 containerd[2294]: time="2026-09-03T18:38:21.459958016Z" level=info msg="Registered namespace \"k8s.io\" with NRI" Sep 3 18:38:21.460532 containerd[2294]: time="2026-09-03T18:38:21.459963312Z" level=info msg="runtime interface starting up..." Sep 3 18:38:21.460532 containerd[2294]: time="2026-09-03T18:38:21.459967568Z" level=info msg="starting plugins..." Sep 3 18:38:21.460532 containerd[2294]: time="2026-09-03T18:38:21.459986360Z" level=info msg="Synchronizing NRI (plugin) with current runtime state" Sep 3 18:38:21.654023 containerd[2294]: time="2026-09-03T18:38:21.653964160Z" level=info msg="loading plugin" id=io.containerd.server.v1.grpc-tcp type=io.containerd.server.v1 Sep 3 18:38:21.654176 containerd[2294]: time="2026-09-03T18:38:21.654160272Z" level=info msg="skip loading plugin" error="skip plugin" id=io.containerd.server.v1.grpc-tcp type=io.containerd.server.v1 Sep 3 18:38:21.654254 containerd[2294]: time="2026-09-03T18:38:21.654241840Z" level=info msg="loading plugin" id=io.containerd.http.v1.pprof type=io.containerd.http.v1 Sep 3 18:38:21.654345 containerd[2294]: time="2026-09-03T18:38:21.654332328Z" level=info msg="loading plugin" id=io.containerd.server.v1.debug type=io.containerd.server.v1 Sep 3 18:38:21.654416 containerd[2294]: time="2026-09-03T18:38:21.654402784Z" level=info msg="skip loading plugin" error="skip plugin" id=io.containerd.server.v1.debug type=io.containerd.server.v1 Sep 3 18:38:21.654735 containerd[2294]: time="2026-09-03T18:38:21.654713928Z" level=info msg=serving... address=/run/containerd/containerd.sock.ttrpc Sep 3 18:38:21.654808 containerd[2294]: time="2026-09-03T18:38:21.654797184Z" level=info msg="starting GRPC server" address=/run/containerd/containerd.sock gid=0 uid=0 Sep 3 18:38:21.654884 containerd[2294]: time="2026-09-03T18:38:21.654873024Z" level=info msg=serving... address=/run/containerd/containerd.sock Sep 3 18:38:21.655563 containerd[2294]: time="2026-09-03T18:38:21.655017264Z" level=info msg="containerd successfully booted in 2.975092s" Sep 3 18:38:21.655270 systemd[1]: Started containerd.service - containerd container runtime. Sep 3 18:38:21.656110 systemd[1]: Reached target multi-user.target - Multi-User System. Sep 3 18:38:21.656375 systemd[1]: Startup finished in 3.203s (kernel) + 18.959s (initrd) + 50.610s (userspace) = 1min 12.772s. Sep 3 18:38:22.021694 waagent[2323]: 2026-09-03T18:38:22.017480Z INFO Daemon Daemon Azure Linux Agent Version: 2.12.0.4 Sep 3 18:38:22.022102 waagent[2323]: 2026-09-03T18:38:22.021877Z INFO Daemon Daemon OS: flatcar 9999.0.0 Sep 3 18:38:22.025728 waagent[2323]: 2026-09-03T18:38:22.025690Z INFO Daemon Daemon Python: 3.13.14 Sep 3 18:38:22.029191 waagent[2323]: 2026-09-03T18:38:22.029152Z INFO Daemon Daemon Run daemon Sep 3 18:38:22.033212 waagent[2323]: 2026-09-03T18:38:22.033010Z INFO Daemon Daemon No RDMA handler exists for distro='Flatcar Container Linux by Kinvolk' version='9999.0.0' Sep 3 18:38:22.039962 waagent[2323]: 2026-09-03T18:38:22.039916Z INFO Daemon Daemon Using waagent for provisioning Sep 3 18:38:22.044179 waagent[2323]: 2026-09-03T18:38:22.044140Z INFO Daemon Daemon Activate resource disk Sep 3 18:38:22.047580 waagent[2323]: 2026-09-03T18:38:22.047546Z INFO Daemon Daemon Searching gen1 prefix 00000000-0001 or gen2 f8b3781a-1e82-4818-a1c3-63d806ec15bb Sep 3 18:38:22.055835 waagent[2323]: 2026-09-03T18:38:22.055794Z INFO Daemon Daemon Found device: None Sep 3 18:38:22.059722 waagent[2323]: 2026-09-03T18:38:22.059683Z ERROR Daemon Daemon Failed to mount resource disk [ResourceDiskError] unable to detect disk topology Sep 3 18:38:22.065723 waagent[2323]: 2026-09-03T18:38:22.065691Z ERROR Daemon Daemon Event: name=WALinuxAgent, op=ActivateResourceDisk, message=[ResourceDiskError] unable to detect disk topology, duration=0 Sep 3 18:38:22.074575 waagent[2323]: 2026-09-03T18:38:22.074536Z INFO Daemon Daemon Clean protocol and wireserver endpoint Sep 3 18:38:22.078813 waagent[2323]: 2026-09-03T18:38:22.078782Z INFO Daemon Daemon Running default provisioning handler Sep 3 18:38:22.087571 waagent[2323]: 2026-09-03T18:38:22.087520Z INFO Daemon Daemon Unable to get cloud-init enabled status from systemctl: Command '['systemctl', 'is-enabled', 'cloud-init-local.service']' returned non-zero exit status 4. Sep 3 18:38:22.098075 waagent[2323]: 2026-09-03T18:38:22.098028Z INFO Daemon Daemon Unable to get cloud-init enabled status from service: [Errno 2] No such file or directory: 'service' Sep 3 18:38:22.105423 waagent[2323]: 2026-09-03T18:38:22.105386Z INFO Daemon Daemon cloud-init is enabled: False Sep 3 18:38:22.109148 waagent[2323]: 2026-09-03T18:38:22.109117Z INFO Daemon Daemon Copying ovf-env.xml Sep 3 18:38:22.123393 waagent[2323]: 2026-09-03T18:38:22.121508Z INFO Daemon Daemon Successfully mounted dvd Sep 3 18:38:22.298094 systemd[1]: mnt-cdrom-secure.mount: Deactivated successfully. Sep 3 18:38:22.299753 waagent[2323]: 2026-09-03T18:38:22.299694Z INFO Daemon Daemon Detect protocol endpoint Sep 3 18:38:22.303396 waagent[2323]: 2026-09-03T18:38:22.303338Z INFO Daemon Daemon Clean protocol and wireserver endpoint Sep 3 18:38:22.307610 waagent[2323]: 2026-09-03T18:38:22.307555Z INFO Daemon Daemon WireServer endpoint is not found. Rerun dhcp handler Sep 3 18:38:22.312742 waagent[2323]: 2026-09-03T18:38:22.312708Z INFO Daemon Daemon Test for route to 168.63.129.16 Sep 3 18:38:22.316737 waagent[2323]: 2026-09-03T18:38:22.316700Z INFO Daemon Daemon Route to 168.63.129.16 exists Sep 3 18:38:22.320500 waagent[2323]: 2026-09-03T18:38:22.320467Z INFO Daemon Daemon Wire server endpoint:168.63.129.16 Sep 3 18:38:22.546429 waagent[2323]: 2026-09-03T18:38:22.546356Z INFO Daemon Daemon Fabric preferred wire protocol version:2015-04-05 Sep 3 18:38:22.551472 waagent[2323]: 2026-09-03T18:38:22.551420Z INFO Daemon Daemon Wire protocol version:2012-11-30 Sep 3 18:38:22.555379 waagent[2323]: 2026-09-03T18:38:22.555347Z INFO Daemon Daemon Server preferred version:2015-04-05 Sep 3 18:38:23.030387 waagent[2323]: 2026-09-03T18:38:23.026344Z INFO Daemon Daemon Initializing goal state during protocol detection Sep 3 18:38:23.031312 waagent[2323]: 2026-09-03T18:38:23.031262Z INFO Daemon Daemon Forcing an update of the goal state. Sep 3 18:38:23.042189 waagent[2323]: 2026-09-03T18:38:23.042142Z INFO Daemon Fetched a new incarnation for the WireServer goal state [incarnation 1] Sep 3 18:38:23.059598 waagent[2323]: 2026-09-03T18:38:23.059560Z INFO Daemon Daemon HostGAPlugin version: 1.0.8.184 Sep 3 18:38:23.064319 waagent[2323]: 2026-09-03T18:38:23.064282Z INFO Daemon Sep 3 18:38:23.066675 waagent[2323]: 2026-09-03T18:38:23.066643Z INFO Daemon Fetched new vmSettings [HostGAPlugin correlation ID: 1ad0f216-c709-456f-990c-dba3cc7dcefa eTag: 1405898459254022444 source: Fabric] Sep 3 18:38:23.075204 waagent[2323]: 2026-09-03T18:38:23.075171Z INFO Daemon The vmSettings originated via Fabric; will ignore them. Sep 3 18:38:23.080602 waagent[2323]: 2026-09-03T18:38:23.080566Z INFO Daemon Sep 3 18:38:23.083003 waagent[2323]: 2026-09-03T18:38:23.082968Z INFO Daemon Fetching full goal state from the WireServer [incarnation 1] Sep 3 18:38:23.124297 waagent[2323]: 2026-09-03T18:38:23.124258Z INFO Daemon Daemon Downloading artifacts profile blob Sep 3 18:38:23.217804 waagent[2323]: 2026-09-03T18:38:23.217734Z INFO Daemon Downloaded certificate {'thumbprint': 'DB4D6B26314BA63DDDDFBCE66039F724E4CC53A8', 'hasPrivateKey': True} Sep 3 18:38:23.225398 waagent[2323]: 2026-09-03T18:38:23.225325Z INFO Daemon Fetch goal state completed Sep 3 18:38:23.234920 waagent[2323]: 2026-09-03T18:38:23.234886Z INFO Daemon Daemon Starting provisioning Sep 3 18:38:23.239007 waagent[2323]: 2026-09-03T18:38:23.238969Z INFO Daemon Daemon Handle ovf-env.xml. Sep 3 18:38:23.242520 waagent[2323]: 2026-09-03T18:38:23.242492Z INFO Daemon Daemon Set hostname [ci-9999.0.0-i-e5ff979d07] Sep 3 18:38:23.585449 waagent[2323]: 2026-09-03T18:38:23.585384Z INFO Daemon Daemon Publish hostname [ci-9999.0.0-i-e5ff979d07] Sep 3 18:38:23.590652 waagent[2323]: 2026-09-03T18:38:23.590599Z INFO Daemon Daemon Examine /proc/net/route for primary interface Sep 3 18:38:23.595304 waagent[2323]: 2026-09-03T18:38:23.595252Z INFO Daemon Daemon Primary interface is [eth0] Sep 3 18:38:23.604423 systemd-networkd[1889]: eth0: Reconfiguring with /usr/lib/systemd/network/zz-default.network. Sep 3 18:38:23.604477 systemd-networkd[1889]: eth0: DHCP lease lost Sep 3 18:38:23.613584 waagent[2323]: 2026-09-03T18:38:23.613531Z INFO Daemon Daemon Create user account if not exists Sep 3 18:38:23.618159 waagent[2323]: 2026-09-03T18:38:23.618101Z INFO Daemon Daemon User core already exists, skip useradd Sep 3 18:38:23.622538 waagent[2323]: 2026-09-03T18:38:23.622501Z INFO Daemon Daemon Configure sudoer Sep 3 18:38:23.626060 waagent[2323]: 2026-09-03T18:38:23.626020Z INFO Daemon Daemon Configure sshd Sep 3 18:38:23.629300 waagent[2323]: 2026-09-03T18:38:23.629261Z INFO Daemon Daemon Added a configuration snippet disabling SSH password-based authentication methods. It also configures SSH client probing to keep connections alive. Sep 3 18:38:23.638936 waagent[2323]: 2026-09-03T18:38:23.638895Z INFO Daemon Daemon Deploy ssh public key. Sep 3 18:38:23.644443 systemd-networkd[1889]: eth0: DHCPv4 address 10.0.0.4/24, gateway 10.0.0.1 acquired from 168.63.129.16 Sep 3 18:38:23.982037 waagent[2323]: 2026-09-03T18:38:23.981969Z INFO Daemon Daemon Decode custom data Sep 3 18:38:23.985627 waagent[2323]: 2026-09-03T18:38:23.985584Z INFO Daemon Daemon Save custom data Sep 3 18:38:25.038468 waagent[2323]: 2026-09-03T18:38:25.038418Z INFO Daemon Daemon Provisioning complete Sep 3 18:38:25.048961 waagent[2323]: 2026-09-03T18:38:25.048922Z INFO Daemon Daemon RDMA capabilities are not enabled, skipping Sep 3 18:38:25.053603 waagent[2323]: 2026-09-03T18:38:25.053568Z INFO Daemon Daemon End of log to /dev/console. The agent will now check for updates and then will process extensions. Sep 3 18:38:25.062281 waagent[2323]: 2026-09-03T18:38:25.062249Z INFO Daemon Daemon Installed Agent WALinuxAgent-2.12.0.4 is the most current agent Sep 3 18:38:25.162451 waagent[2498]: 2026-09-03T18:38:25.162382Z INFO ExtHandler ExtHandler Azure Linux Agent (Goal State Agent version 2.12.0.4) Sep 3 18:38:25.163281 waagent[2498]: 2026-09-03T18:38:25.162918Z INFO ExtHandler ExtHandler OS: flatcar 9999.0.0 Sep 3 18:38:25.163281 waagent[2498]: 2026-09-03T18:38:25.162987Z INFO ExtHandler ExtHandler Python: 3.13.14 Sep 3 18:38:25.163281 waagent[2498]: 2026-09-03T18:38:25.163028Z INFO ExtHandler ExtHandler CPU Arch: aarch64 Sep 3 18:38:25.401697 waagent[2498]: 2026-09-03T18:38:25.401570Z INFO ExtHandler ExtHandler Distro: flatcar-9999.0.0; OSUtil: FlatcarUtil; AgentService: waagent; Python: 3.13.14; Arch: aarch64; systemd: True; LISDrivers: Absent; logrotate: logrotate 3.22.0; Sep 3 18:38:25.402024 waagent[2498]: 2026-09-03T18:38:25.401993Z INFO ExtHandler ExtHandler WireServer endpoint 168.63.129.16 read from file Sep 3 18:38:25.402176 waagent[2498]: 2026-09-03T18:38:25.402152Z INFO ExtHandler ExtHandler Wire server endpoint:168.63.129.16 Sep 3 18:38:25.409096 waagent[2498]: 2026-09-03T18:38:25.409049Z INFO ExtHandler Fetched a new incarnation for the WireServer goal state [incarnation 1] Sep 3 18:38:25.414409 waagent[2498]: 2026-09-03T18:38:25.414140Z INFO ExtHandler ExtHandler HostGAPlugin version: 1.0.8.184 Sep 3 18:38:25.414586 waagent[2498]: 2026-09-03T18:38:25.414549Z INFO ExtHandler Sep 3 18:38:25.414647 waagent[2498]: 2026-09-03T18:38:25.414626Z INFO ExtHandler Fetched new vmSettings [HostGAPlugin correlation ID: 939dd7a7-8ffc-4597-9d8d-4e63e01c1acf eTag: 1405898459254022444 source: Fabric] Sep 3 18:38:25.414868 waagent[2498]: 2026-09-03T18:38:25.414841Z INFO ExtHandler The vmSettings originated via Fabric; will ignore them. Sep 3 18:38:25.415290 waagent[2498]: 2026-09-03T18:38:25.415259Z INFO ExtHandler Sep 3 18:38:25.415336 waagent[2498]: 2026-09-03T18:38:25.415318Z INFO ExtHandler Fetching full goal state from the WireServer [incarnation 1] Sep 3 18:38:25.418165 waagent[2498]: 2026-09-03T18:38:25.418134Z INFO ExtHandler ExtHandler Downloading artifacts profile blob Sep 3 18:38:25.491017 waagent[2498]: 2026-09-03T18:38:25.490940Z INFO ExtHandler Downloaded certificate {'thumbprint': 'DB4D6B26314BA63DDDDFBCE66039F724E4CC53A8', 'hasPrivateKey': True} Sep 3 18:38:25.491449 waagent[2498]: 2026-09-03T18:38:25.491411Z INFO ExtHandler Fetch goal state completed Sep 3 18:38:25.500894 waagent[2498]: 2026-09-03T18:38:25.500839Z INFO ExtHandler ExtHandler OpenSSL version: OpenSSL 3.5.7 9 Jun 2026 (Library: OpenSSL 3.5.7 9 Jun 2026) Sep 3 18:38:25.504295 waagent[2498]: 2026-09-03T18:38:25.504244Z INFO ExtHandler ExtHandler WALinuxAgent-2.12.0.4 running as process 2498 Sep 3 18:38:25.504434 waagent[2498]: 2026-09-03T18:38:25.504402Z INFO ExtHandler ExtHandler ******** AutoUpdate.Enabled is set to False, not processing the operation ******** Sep 3 18:38:25.504696 waagent[2498]: 2026-09-03T18:38:25.504664Z INFO ExtHandler ExtHandler ******** AutoUpdate.UpdateToLatestVersion is set to False, not processing the operation ******** Sep 3 18:38:25.505829 waagent[2498]: 2026-09-03T18:38:25.505790Z INFO ExtHandler ExtHandler [CGI] Cgroup monitoring is not supported on ['flatcar', '9999.0.0', '', 'Flatcar Container Linux by Kinvolk'] Sep 3 18:38:25.506149 waagent[2498]: 2026-09-03T18:38:25.506116Z INFO ExtHandler ExtHandler [CGI] Agent will reset the quotas in case distro: ['flatcar', '9999.0.0', '', 'Flatcar Container Linux by Kinvolk'] went from supported to unsupported Sep 3 18:38:25.506245 waagent[2498]: 2026-09-03T18:38:25.506221Z INFO ExtHandler ExtHandler [CGI] Agent cgroups enabled: False Sep 3 18:38:25.506705 waagent[2498]: 2026-09-03T18:38:25.506670Z INFO ExtHandler ExtHandler Starting setup for Persistent firewall rules Sep 3 18:38:25.751302 waagent[2498]: 2026-09-03T18:38:25.751263Z INFO ExtHandler ExtHandler Firewalld service not running/unavailable, trying to set up waagent-network-setup.service Sep 3 18:38:25.751533 waagent[2498]: 2026-09-03T18:38:25.751498Z INFO ExtHandler ExtHandler Successfully updated the Binary file /var/lib/waagent/waagent-network-setup.py for firewall setup Sep 3 18:38:25.755727 waagent[2498]: 2026-09-03T18:38:25.755696Z INFO ExtHandler ExtHandler Service: waagent-network-setup.service not enabled. Adding it now Sep 3 18:38:25.760318 systemd[1]: Reload requested from client PID 2517 ('systemctl') (unit waagent.service)... Sep 3 18:38:25.760657 systemd[1]: Reloading... Sep 3 18:38:25.835393 zram_generator::config[2564]: No configuration found. Sep 3 18:38:26.062758 systemd[1]: Reloading finished in 301 ms. Sep 3 18:38:26.084474 waagent[2498]: 2026-09-03T18:38:26.084396Z INFO ExtHandler ExtHandler Successfully added and enabled the waagent-network-setup.service Sep 3 18:38:26.084670 waagent[2498]: 2026-09-03T18:38:26.084565Z INFO ExtHandler ExtHandler Persistent firewall rules setup successfully Sep 3 18:38:26.570384 waagent[2498]: 2026-09-03T18:38:26.570289Z INFO ExtHandler ExtHandler DROP rule is not available which implies no firewall rules are set yet. Environment thread will set it up. Sep 3 18:38:26.570721 waagent[2498]: 2026-09-03T18:38:26.570607Z INFO ExtHandler ExtHandler Checking if log collection is allowed at this time [False]. All three conditions must be met: 1. configuration enabled [True], 2. cgroups v1 enabled [False] OR cgroups v2 is in use and v2 resource limiting configuration enabled [False], 3. python supported: [True] Sep 3 18:38:26.571321 waagent[2498]: 2026-09-03T18:38:26.571274Z INFO ExtHandler ExtHandler Starting env monitor service. Sep 3 18:38:26.571708 waagent[2498]: 2026-09-03T18:38:26.571619Z INFO ExtHandler ExtHandler Start SendTelemetryHandler service. Sep 3 18:38:26.572387 waagent[2498]: 2026-09-03T18:38:26.571893Z INFO MonitorHandler ExtHandler WireServer endpoint 168.63.129.16 read from file Sep 3 18:38:26.572387 waagent[2498]: 2026-09-03T18:38:26.571972Z INFO MonitorHandler ExtHandler Wire server endpoint:168.63.129.16 Sep 3 18:38:26.572387 waagent[2498]: 2026-09-03T18:38:26.572150Z INFO MonitorHandler ExtHandler Monitor.NetworkConfigurationChanges is disabled. Sep 3 18:38:26.572387 waagent[2498]: 2026-09-03T18:38:26.572290Z INFO MonitorHandler ExtHandler Routing table from /proc/net/route: Sep 3 18:38:26.572387 waagent[2498]: Iface Destination Gateway Flags RefCnt Use Metric Mask MTU Window IRTT Sep 3 18:38:26.572387 waagent[2498]: eth0 00000000 0100000A 0003 0 0 1024 00000000 0 0 0 Sep 3 18:38:26.572387 waagent[2498]: eth0 0000000A 00000000 0001 0 0 1024 00FFFFFF 0 0 0 Sep 3 18:38:26.572387 waagent[2498]: eth0 0100000A 00000000 0005 0 0 1024 FFFFFFFF 0 0 0 Sep 3 18:38:26.572387 waagent[2498]: eth0 10813FA8 0100000A 0007 0 0 1024 FFFFFFFF 0 0 0 Sep 3 18:38:26.572387 waagent[2498]: eth0 FEA9FEA9 0100000A 0007 0 0 1024 FFFFFFFF 0 0 0 Sep 3 18:38:26.572736 waagent[2498]: 2026-09-03T18:38:26.572702Z INFO SendTelemetryHandler ExtHandler Successfully started the SendTelemetryHandler thread Sep 3 18:38:26.572932 waagent[2498]: 2026-09-03T18:38:26.572885Z INFO ExtHandler ExtHandler Start Extension Telemetry service. Sep 3 18:38:26.573217 waagent[2498]: 2026-09-03T18:38:26.573181Z INFO EnvHandler ExtHandler WireServer endpoint 168.63.129.16 read from file Sep 3 18:38:26.573316 waagent[2498]: 2026-09-03T18:38:26.573276Z INFO TelemetryEventsCollector ExtHandler Extension Telemetry pipeline enabled: True Sep 3 18:38:26.573486 waagent[2498]: 2026-09-03T18:38:26.573452Z INFO TelemetryEventsCollector ExtHandler Successfully started the TelemetryEventsCollector thread Sep 3 18:38:26.573619 waagent[2498]: 2026-09-03T18:38:26.573581Z INFO EnvHandler ExtHandler Wire server endpoint:168.63.129.16 Sep 3 18:38:26.573722 waagent[2498]: 2026-09-03T18:38:26.573689Z INFO ExtHandler ExtHandler Goal State Period: 6 sec. This indicates how often the agent checks for new goal states and reports status. Sep 3 18:38:26.574810 waagent[2498]: 2026-09-03T18:38:26.574771Z INFO EnvHandler ExtHandler Configure routes Sep 3 18:38:26.575128 waagent[2498]: 2026-09-03T18:38:26.575090Z INFO EnvHandler ExtHandler Gateway:None Sep 3 18:38:26.575404 waagent[2498]: 2026-09-03T18:38:26.575354Z INFO EnvHandler ExtHandler Routes:None Sep 3 18:38:26.583403 waagent[2498]: 2026-09-03T18:38:26.582079Z INFO ExtHandler ExtHandler Sep 3 18:38:26.583403 waagent[2498]: 2026-09-03T18:38:26.582160Z INFO ExtHandler ExtHandler ProcessExtensionsGoalState started [incarnation_1 channel: WireServer source: Fabric activity: dfe95391-58cb-4872-a78a-f08256e727f5 correlation 5c5ef413-7a10-4406-a4d8-c56037d35d75 created: 2026-09-03T18:36:47.036636Z] Sep 3 18:38:26.583403 waagent[2498]: 2026-09-03T18:38:26.582455Z INFO ExtHandler ExtHandler No extension handlers found, not processing anything. Sep 3 18:38:26.583403 waagent[2498]: 2026-09-03T18:38:26.582859Z INFO ExtHandler ExtHandler ProcessExtensionsGoalState completed [incarnation_1 0 ms] Sep 3 18:38:26.607876 waagent[2498]: 2026-09-03T18:38:26.607821Z INFO ExtHandler ExtHandler [HEARTBEAT] Agent WALinuxAgent-2.12.0.4 is running as the goal state agent [DEBUG HeartbeatCounter: 0;HeartbeatId: 88710C34-FF44-4FB5-89A3-40989D367B90;DroppedPackets: 0;UpdateGSErrors: 0;AutoUpdate: 0;UpdateMode: SelfUpdate;] Sep 3 18:38:26.647452 waagent[2498]: 2026-09-03T18:38:26.647019Z INFO MonitorHandler ExtHandler Network interfaces: Sep 3 18:38:26.647452 waagent[2498]: Executing ['ip', '-a', '-o', 'link']: Sep 3 18:38:26.647452 waagent[2498]: 1: lo: mtu 65536 qdisc noqueue state UNKNOWN mode DEFAULT group default qlen 1000\ link/loopback 00:00:00:00:00:00 brd 00:00:00:00:00:00 Sep 3 18:38:26.647452 waagent[2498]: 2: eth0: mtu 1500 qdisc mq state UP mode DEFAULT group default qlen 1000\ link/ether 7c:ed:8d:c7:f8:ba brd ff:ff:ff:ff:ff:ff\ altname enx7ced8dc7f8ba Sep 3 18:38:26.647452 waagent[2498]: 3: enP57341s1: mtu 1500 qdisc mq master eth0 state UP mode DEFAULT group default qlen 1000\ link/ether 7c:ed:8d:c7:f8:ba brd ff:ff:ff:ff:ff:ff\ altname enP57341p0s2 Sep 3 18:38:26.647452 waagent[2498]: Executing ['ip', '-4', '-a', '-o', 'address']: Sep 3 18:38:26.647452 waagent[2498]: 1: lo inet 127.0.0.1/8 scope host lo\ valid_lft forever preferred_lft forever Sep 3 18:38:26.647452 waagent[2498]: 2: eth0 inet 10.0.0.4/24 metric 1024 brd 10.0.0.255 scope global eth0\ valid_lft forever preferred_lft forever Sep 3 18:38:26.647452 waagent[2498]: Executing ['ip', '-6', '-a', '-o', 'address']: Sep 3 18:38:26.647452 waagent[2498]: 1: lo inet6 ::1/128 scope host noprefixroute \ valid_lft forever preferred_lft forever Sep 3 18:38:26.647452 waagent[2498]: 2: eth0 inet6 fe80::7eed:8dff:fec7:f8ba/64 scope link proto kernel_ll \ valid_lft forever preferred_lft forever Sep 3 18:38:26.662776 waagent[2498]: 2026-09-03T18:38:26.662724Z INFO EnvHandler ExtHandler Created firewall rules for the Azure Fabric: Sep 3 18:38:26.662776 waagent[2498]: Chain INPUT (policy ACCEPT 0 packets, 0 bytes) Sep 3 18:38:26.662776 waagent[2498]: pkts bytes target prot opt in out source destination Sep 3 18:38:26.662776 waagent[2498]: Chain FORWARD (policy ACCEPT 0 packets, 0 bytes) Sep 3 18:38:26.662776 waagent[2498]: pkts bytes target prot opt in out source destination Sep 3 18:38:26.662776 waagent[2498]: Chain OUTPUT (policy ACCEPT 0 packets, 0 bytes) Sep 3 18:38:26.662776 waagent[2498]: pkts bytes target prot opt in out source destination Sep 3 18:38:26.662776 waagent[2498]: 0 0 ACCEPT tcp -- * * 0.0.0.0/0 168.63.129.16 tcp dpt:53 Sep 3 18:38:26.662776 waagent[2498]: 0 0 ACCEPT tcp -- * * 0.0.0.0/0 168.63.129.16 owner UID match 0 Sep 3 18:38:26.662776 waagent[2498]: 0 0 DROP tcp -- * * 0.0.0.0/0 168.63.129.16 ctstate INVALID,NEW Sep 3 18:38:26.665769 waagent[2498]: 2026-09-03T18:38:26.665720Z INFO EnvHandler ExtHandler Current Firewall rules: Sep 3 18:38:26.665769 waagent[2498]: Chain INPUT (policy ACCEPT 0 packets, 0 bytes) Sep 3 18:38:26.665769 waagent[2498]: pkts bytes target prot opt in out source destination Sep 3 18:38:26.665769 waagent[2498]: Chain FORWARD (policy ACCEPT 0 packets, 0 bytes) Sep 3 18:38:26.665769 waagent[2498]: pkts bytes target prot opt in out source destination Sep 3 18:38:26.665769 waagent[2498]: Chain OUTPUT (policy ACCEPT 0 packets, 0 bytes) Sep 3 18:38:26.665769 waagent[2498]: pkts bytes target prot opt in out source destination Sep 3 18:38:26.665769 waagent[2498]: 0 0 ACCEPT tcp -- * * 0.0.0.0/0 168.63.129.16 tcp dpt:53 Sep 3 18:38:26.665769 waagent[2498]: 2 112 ACCEPT tcp -- * * 0.0.0.0/0 168.63.129.16 owner UID match 0 Sep 3 18:38:26.665769 waagent[2498]: 0 0 DROP tcp -- * * 0.0.0.0/0 168.63.129.16 ctstate INVALID,NEW Sep 3 18:38:26.665992 waagent[2498]: 2026-09-03T18:38:26.665963Z INFO EnvHandler ExtHandler Set block dev timeout: sda with timeout: 300 Sep 3 18:38:33.636515 chronyd[2127]: Selected source PHC0 Sep 3 18:38:34.284789 kernel: hv_balloon: Max. dynamic memory size: 4096 MB Sep 3 18:38:35.460737 systemd[1]: Started sshd@1-2-10.0.0.4:22-20.101.212.173:35668.service - OpenSSH per-connection server daemon (20.101.212.173:35668). Sep 3 18:38:36.194206 sshd[2653]: Accepted publickey for core from 20.101.212.173 port 35668 ssh2: RSA SHA256:Z1AEOIPpiEf4oyezy7Ty5LB5dUUqMfpgZOmh2MqfE08 Sep 3 18:38:36.195391 sshd-session[2653]: pam_unix(sshd:session): session opened for user core(uid=500) by core(uid=0) Sep 3 18:38:36.206529 systemd[1]: Starting user@500.service - User Manager for UID 500... Sep 3 18:38:36.210015 systemd-logind[2142]: New session '3' of user 'core' with class 'user' and type 'tty'. Sep 3 18:38:36.215557 (systemd)[2657]: pam_unix(systemd-user:session): session opened for user core(uid=500) by core(uid=0) Sep 3 18:38:36.217726 systemd-logind[2142]: New session '4' of user 'core' with class 'manager-early' and type 'unspecified'. Sep 3 18:38:36.431885 systemd[2657]: Queued start job for default target default.target. Sep 3 18:38:36.442490 systemd[2657]: Created slice app.slice - User Application Slice. Sep 3 18:38:36.442520 systemd[2657]: Started systemd-tmpfiles-clean.timer - Daily Cleanup of User's Temporary Directories. Sep 3 18:38:36.442530 systemd[2657]: Reached target machines.target - Virtual Machines and Containers. Sep 3 18:38:36.442573 systemd[2657]: Reached target paths.target - Paths. Sep 3 18:38:36.442590 systemd[2657]: Reached target timers.target - Timers. Sep 3 18:38:36.443591 systemd[2657]: Starting dbus.socket - D-Bus User Message Bus Socket... Sep 3 18:38:36.444767 systemd[2657]: Listening on systemd-ask-password.socket - Query the User Interactively for a Password. Sep 3 18:38:36.444893 systemd[2657]: Listening on systemd-importd.socket - Disk Image Download Service Socket. Sep 3 18:38:36.445558 systemd[2657]: Listening on systemd-journalctl.socket - Journal Log Access Socket. Sep 3 18:38:36.445713 systemd[2657]: Listening on systemd-machined.socket - Virtual Machine and Container Registration Service Socket. Sep 3 18:38:36.448524 systemd[2657]: Starting systemd-tmpfiles-setup.service - Create User Files and Directories... Sep 3 18:38:36.453484 systemd[2657]: Listening on dbus.socket - D-Bus User Message Bus Socket. Sep 3 18:38:36.453563 systemd[2657]: Reached target sockets.target - Sockets. Sep 3 18:38:36.456798 systemd[2657]: Finished systemd-tmpfiles-setup.service - Create User Files and Directories. Sep 3 18:38:36.456858 systemd[2657]: Reached target basic.target - Basic System. Sep 3 18:38:36.456903 systemd[2657]: Reached target default.target - Main User Target. Sep 3 18:38:36.456924 systemd[2657]: Startup finished in 234ms. Sep 3 18:38:36.457444 systemd[1]: Started user@500.service - User Manager for UID 500. Sep 3 18:38:36.463515 systemd[1]: Started session-3.scope - Session 3 of User core. Sep 3 18:38:36.901656 systemd[1]: Started sshd@2-3-10.0.0.4:22-20.101.212.173:35670.service - OpenSSH per-connection server daemon (20.101.212.173:35670). Sep 3 18:38:37.635238 sshd[2671]: Accepted publickey for core from 20.101.212.173 port 35670 ssh2: RSA SHA256:Z1AEOIPpiEf4oyezy7Ty5LB5dUUqMfpgZOmh2MqfE08 Sep 3 18:38:37.636291 sshd-session[2671]: pam_unix(sshd:session): session opened for user core(uid=500) by core(uid=0) Sep 3 18:38:37.639801 systemd-logind[2142]: New session '5' of user 'core' with class 'user' and type 'tty'. Sep 3 18:38:37.645524 systemd[1]: Started session-5.scope - Session 5 of User core. Sep 3 18:38:38.057410 sshd[2675]: Connection closed by 20.101.212.173 port 35670 Sep 3 18:38:38.058076 sshd-session[2671]: pam_unix(sshd:session): session closed for user core Sep 3 18:38:38.060901 systemd[1]: sshd@2-3-10.0.0.4:22-20.101.212.173:35670.service: Deactivated successfully. Sep 3 18:38:38.062520 systemd[1]: session-5.scope: Deactivated successfully. Sep 3 18:38:38.063240 systemd-logind[2142]: Session 5 logged out. Waiting for processes to exit. Sep 3 18:38:38.064429 systemd-logind[2142]: Removed session 5. Sep 3 18:38:38.207280 systemd[1]: Started sshd@3-4-10.0.0.4:22-20.101.212.173:35682.service - OpenSSH per-connection server daemon (20.101.212.173:35682). Sep 3 18:38:38.940844 sshd[2681]: Accepted publickey for core from 20.101.212.173 port 35682 ssh2: RSA SHA256:Z1AEOIPpiEf4oyezy7Ty5LB5dUUqMfpgZOmh2MqfE08 Sep 3 18:38:38.941963 sshd-session[2681]: pam_unix(sshd:session): session opened for user core(uid=500) by core(uid=0) Sep 3 18:38:38.945769 systemd-logind[2142]: New session '6' of user 'core' with class 'user' and type 'tty'. Sep 3 18:38:38.954693 systemd[1]: Started session-6.scope - Session 6 of User core. Sep 3 18:38:39.359207 sshd[2685]: Connection closed by 20.101.212.173 port 35682 Sep 3 18:38:39.359824 sshd-session[2681]: pam_unix(sshd:session): session closed for user core Sep 3 18:38:39.362791 systemd[1]: sshd@3-4-10.0.0.4:22-20.101.212.173:35682.service: Deactivated successfully. Sep 3 18:38:39.364761 systemd[1]: session-6.scope: Deactivated successfully. Sep 3 18:38:39.365809 systemd-logind[2142]: Session 6 logged out. Waiting for processes to exit. Sep 3 18:38:39.367528 systemd-logind[2142]: Removed session 6. Sep 3 18:38:39.509505 systemd[1]: Started sshd@4-5-10.0.0.4:22-20.101.212.173:57706.service - OpenSSH per-connection server daemon (20.101.212.173:57706). Sep 3 18:38:40.243212 sshd[2691]: Accepted publickey for core from 20.101.212.173 port 57706 ssh2: RSA SHA256:Z1AEOIPpiEf4oyezy7Ty5LB5dUUqMfpgZOmh2MqfE08 Sep 3 18:38:40.244295 sshd-session[2691]: pam_unix(sshd:session): session opened for user core(uid=500) by core(uid=0) Sep 3 18:38:40.247927 systemd-logind[2142]: New session '7' of user 'core' with class 'user' and type 'tty'. Sep 3 18:38:40.255699 systemd[1]: Started session-7.scope - Session 7 of User core. Sep 3 18:38:40.665357 sshd[2695]: Connection closed by 20.101.212.173 port 57706 Sep 3 18:38:40.666113 sshd-session[2691]: pam_unix(sshd:session): session closed for user core Sep 3 18:38:40.668903 systemd[1]: sshd@4-5-10.0.0.4:22-20.101.212.173:57706.service: Deactivated successfully. Sep 3 18:38:40.670999 systemd[1]: session-7.scope: Deactivated successfully. Sep 3 18:38:40.672028 systemd-logind[2142]: Session 7 logged out. Waiting for processes to exit. Sep 3 18:38:40.674508 systemd-logind[2142]: Removed session 7. Sep 3 18:38:40.815199 systemd[1]: Started sshd@5-4097-10.0.0.4:22-20.101.212.173:57714.service - OpenSSH per-connection server daemon (20.101.212.173:57714). Sep 3 18:38:41.548719 sshd[2701]: Accepted publickey for core from 20.101.212.173 port 57714 ssh2: RSA SHA256:Z1AEOIPpiEf4oyezy7Ty5LB5dUUqMfpgZOmh2MqfE08 Sep 3 18:38:41.549633 sshd-session[2701]: pam_unix(sshd:session): session opened for user core(uid=500) by core(uid=0) Sep 3 18:38:41.553413 systemd-logind[2142]: New session '8' of user 'core' with class 'user' and type 'tty'. Sep 3 18:38:41.562544 systemd[1]: Started session-8.scope - Session 8 of User core. Sep 3 18:38:41.971051 sshd[2705]: Connection closed by 20.101.212.173 port 57714 Sep 3 18:38:41.969962 sshd-session[2701]: pam_unix(sshd:session): session closed for user core Sep 3 18:38:41.972572 systemd[1]: sshd@5-4097-10.0.0.4:22-20.101.212.173:57714.service: Deactivated successfully. Sep 3 18:38:41.974204 systemd[1]: session-8.scope: Deactivated successfully. Sep 3 18:38:41.978135 systemd-logind[2142]: Session 8 logged out. Waiting for processes to exit. Sep 3 18:38:41.978981 systemd-logind[2142]: Removed session 8. Sep 3 18:38:42.119431 systemd[1]: Started sshd@6-4098-10.0.0.4:22-20.101.212.173:57728.service - OpenSSH per-connection server daemon (20.101.212.173:57728). Sep 3 18:38:42.853033 sshd[2711]: Accepted publickey for core from 20.101.212.173 port 57728 ssh2: RSA SHA256:Z1AEOIPpiEf4oyezy7Ty5LB5dUUqMfpgZOmh2MqfE08 Sep 3 18:38:42.853887 sshd-session[2711]: pam_unix(sshd:session): session opened for user core(uid=500) by core(uid=0) Sep 3 18:38:42.857614 systemd-logind[2142]: New session '9' of user 'core' with class 'user' and type 'tty'. Sep 3 18:38:42.864707 systemd[1]: Started session-9.scope - Session 9 of User core. Sep 3 18:38:43.276772 sshd[2715]: Connection closed by 20.101.212.173 port 57728 Sep 3 18:38:43.275698 sshd-session[2711]: pam_unix(sshd:session): session closed for user core Sep 3 18:38:43.278528 systemd[1]: sshd@6-4098-10.0.0.4:22-20.101.212.173:57728.service: Deactivated successfully. Sep 3 18:38:43.280619 systemd[1]: session-9.scope: Deactivated successfully. Sep 3 18:38:43.283999 systemd-logind[2142]: Session 9 logged out. Waiting for processes to exit. Sep 3 18:38:43.284905 systemd-logind[2142]: Removed session 9.