Oct 19 14:32:17.125981 kernel: Linux version 6.18.45-flatcar (build@pony-truck.infra.kinvolk.io) (x86_64-cros-linux-gnu-gcc (Gentoo Hardened 15.3.0 p8) 15.3.0, GNU ld (Gentoo 2.46.1 p1) 2.46.1) #1 SMP PREEMPT_DYNAMIC Mon Oct 19 12:16:53 -00 2026
Oct 19 14:32:17.126010 kernel: Command line: BOOT_IMAGE=/flatcar/vmlinuz-a mount.usr=/dev/mapper/usr verity.usr=PARTUUID=7130c94a-213a-4e5a-8e26-6cce9662f132 rootflags=rw mount.usrflags=ro consoleblank=0 root=LABEL=ROOT console=tty1 console=ttyS0,115200n8 earlyprintk=ttyS0,115200 flatcar.first_boot=detected flatcar.oem.id=azure flatcar.autologin verity.usrhash=1965178a28db43350a0cd55c710101aee06f10df191fb062190e930135599d4e
Oct 19 14:32:17.126020 kernel: BIOS-provided physical RAM map:
Oct 19 14:32:17.126028 kernel: BIOS-e820: [mem 0x0000000000000000-0x000000000009ffff] usable
Oct 19 14:32:17.126034 kernel: BIOS-e820: [mem 0x00000000000c0000-0x00000000000fffff] reserved
Oct 19 14:32:17.126042 kernel: BIOS-e820: [mem 0x0000000000100000-0x00000000044fdfff] usable
Oct 19 14:32:17.126051 kernel: BIOS-e820: [mem 0x00000000044fe000-0x00000000048fdfff] reserved
Oct 19 14:32:17.126058 kernel: BIOS-e820: [mem 0x00000000048fe000-0x000000003ff1efff] usable
Oct 19 14:32:17.126066 kernel: BIOS-e820: [mem 0x000000003ff1f000-0x000000003ffc8fff] reserved
Oct 19 14:32:17.126073 kernel: BIOS-e820: [mem 0x000000003ffc9000-0x000000003fffafff] ACPI data
Oct 19 14:32:17.126090 kernel: BIOS-e820: [mem 0x000000003fffb000-0x000000003fffefff] ACPI NVS
Oct 19 14:32:17.126098 kernel: BIOS-e820: [mem 0x000000003ffff000-0x000000003fffffff] usable
Oct 19 14:32:17.126104 kernel: BIOS-e820: [mem 0x0000000100000000-0x00000002bfffffff] usable
Oct 19 14:32:17.126112 kernel: printk: legacy bootconsole [earlyser0] enabled
Oct 19 14:32:17.126121 kernel: NX (Execute Disable) protection: active
Oct 19 14:32:17.126129 kernel: APIC: Static calls initialized
Oct 19 14:32:17.126136 kernel: efi: EFI v2.7 by Microsoft
Oct 19 14:32:17.126146 kernel: efi: ACPI=0x3fffa000 ACPI 2.0=0x3fffa014 SMBIOS=0x3ff88000 SMBIOS 3.0=0x3ff86000 MEMATTR=0x3ea6c018 RNG=0x3ffd2018 
Oct 19 14:32:17.126153 kernel: random: crng init done
Oct 19 14:32:17.126161 kernel: secureboot: Secure boot disabled
Oct 19 14:32:17.126168 kernel: SMBIOS 3.1.0 present.
Oct 19 14:32:17.126182 kernel: DMI: Microsoft Corporation Virtual Machine/Virtual Machine, BIOS Hyper-V UEFI Release v4.1 04/22/2026
Oct 19 14:32:17.126188 kernel: DMI: Memory slots populated: 2/2
Oct 19 14:32:17.126195 kernel: Hypervisor detected: Microsoft Hyper-V
Oct 19 14:32:17.126213 kernel: Hyper-V: privilege flags low 0xae7f, high 0x3b8030, ext 0x62, hints 0x9e4e24, misc 0xe0bed7b2
Oct 19 14:32:17.126220 kernel: Hyper-V: Nested features: 0x3e0101
Oct 19 14:32:17.126226 kernel: Hyper-V: LAPIC Timer Frequency: 0x30d40
Oct 19 14:32:17.126233 kernel: Hyper-V: Using hypercall for remote TLB flush
Oct 19 14:32:17.126242 kernel: clocksource: hyperv_clocksource_tsc_page: mask: 0xffffffffffffffff max_cycles: 0x24e6a1710, max_idle_ns: 440795202120 ns
Oct 19 14:32:17.126248 kernel: clocksource: hyperv_clocksource_msr: mask: 0xffffffffffffffff max_cycles: 0x24e6a1710, max_idle_ns: 440795202120 ns
Oct 19 14:32:17.126255 kernel: tsc: Detected 2300.001 MHz processor
Oct 19 14:32:17.126262 kernel: e820: update [mem 0x00000000-0x00000fff] usable ==> reserved
Oct 19 14:32:17.126270 kernel: e820: remove [mem 0x000a0000-0x000fffff] usable
Oct 19 14:32:17.126277 kernel: last_pfn = 0x2c0000 max_arch_pfn = 0x10000000000
Oct 19 14:32:17.126284 kernel: MTRR map: 4 entries (2 fixed + 2 variable; max 18), built from 8 variable MTRRs
Oct 19 14:32:17.126292 kernel: x86/PAT: Configuration [0-7]: WB  WC  UC- UC  WB  WP  UC- WT  
Oct 19 14:32:17.126302 kernel: e820: update [mem 0x48000000-0xffffffff] usable ==> reserved
Oct 19 14:32:17.126309 kernel: last_pfn = 0x40000 max_arch_pfn = 0x10000000000
Oct 19 14:32:17.126316 kernel: Using GB pages for direct mapping
Oct 19 14:32:17.126323 kernel: ACPI: Early table checksum verification disabled
Oct 19 14:32:17.126334 kernel: ACPI: RSDP 0x000000003FFFA014 000024 (v02 VRTUAL)
Oct 19 14:32:17.126343 kernel: ACPI: XSDT 0x000000003FFF90E8 00005C (v01 VRTUAL MICROSFT 00000001 MSFT 00000001)
Oct 19 14:32:17.126352 kernel: ACPI: FACP 0x000000003FFF8000 000114 (v06 VRTUAL MICROSFT 00000001 MSFT 00000001)
Oct 19 14:32:17.126360 kernel: ACPI: DSDT 0x000000003FFD6000 01E22B (v02 MSFTVM DSDT01   00000001 INTL 20230628)
Oct 19 14:32:17.126368 kernel: ACPI: FACS 0x000000003FFFE000 000040
Oct 19 14:32:17.126376 kernel: ACPI: OEM0 0x000000003FFF7000 000064 (v01 VRTUAL MICROSFT 00000001 MSFT 00000001)
Oct 19 14:32:17.126383 kernel: ACPI: SPCR 0x000000003FFF6000 000050 (v02 VRTUAL MICROSFT 00000001 MSFT 00000001)
Oct 19 14:32:17.126393 kernel: ACPI: WAET 0x000000003FFF5000 000028 (v01 VRTUAL MICROSFT 00000001 MSFT 00000001)
Oct 19 14:32:17.126401 kernel: ACPI: APIC 0x000000003FFD5000 000058 (v05 HVLITE HVLITETB 00000000 MSHV 00000000)
Oct 19 14:32:17.126409 kernel: ACPI: SRAT 0x000000003FFD4000 0000A0 (v03 HVLITE HVLITETB 00000000 MSHV 00000000)
Oct 19 14:32:17.126417 kernel: ACPI: BGRT 0x000000003FFD3000 000038 (v01 VRTUAL MICROSFT 00000001 MSFT 00000001)
Oct 19 14:32:17.126425 kernel: ACPI: Reserving FACP table memory at [mem 0x3fff8000-0x3fff8113]
Oct 19 14:32:17.126434 kernel: ACPI: Reserving DSDT table memory at [mem 0x3ffd6000-0x3fff422a]
Oct 19 14:32:17.126442 kernel: ACPI: Reserving FACS table memory at [mem 0x3fffe000-0x3fffe03f]
Oct 19 14:32:17.126452 kernel: ACPI: Reserving OEM0 table memory at [mem 0x3fff7000-0x3fff7063]
Oct 19 14:32:17.126461 kernel: ACPI: Reserving SPCR table memory at [mem 0x3fff6000-0x3fff604f]
Oct 19 14:32:17.126469 kernel: ACPI: Reserving WAET table memory at [mem 0x3fff5000-0x3fff5027]
Oct 19 14:32:17.126477 kernel: ACPI: Reserving APIC table memory at [mem 0x3ffd5000-0x3ffd5057]
Oct 19 14:32:17.126486 kernel: ACPI: Reserving SRAT table memory at [mem 0x3ffd4000-0x3ffd409f]
Oct 19 14:32:17.126494 kernel: ACPI: Reserving BGRT table memory at [mem 0x3ffd3000-0x3ffd3037]
Oct 19 14:32:17.126502 kernel: ACPI: SRAT: Node 0 PXM 0 [mem 0x00000000-0x3fffffff]
Oct 19 14:32:17.126512 kernel: ACPI: SRAT: Node 0 PXM 0 [mem 0x100000000-0x2bfffffff]
Oct 19 14:32:17.126521 kernel: NUMA: Node 0 [mem 0x00001000-0x3fffffff] + [mem 0x100000000-0x2bfffffff] -> [mem 0x00001000-0x2bfffffff]
Oct 19 14:32:17.126529 kernel: NODE_DATA(0) allocated [mem 0x2bfff8d80-0x2bfffffff]
Oct 19 14:32:17.126537 kernel: Zone ranges:
Oct 19 14:32:17.126546 kernel:   DMA      [mem 0x0000000000001000-0x0000000000ffffff]
Oct 19 14:32:17.126555 kernel:   DMA32    [mem 0x0000000001000000-0x00000000ffffffff]
Oct 19 14:32:17.126563 kernel:   Normal   [mem 0x0000000100000000-0x00000002bfffffff]
Oct 19 14:32:17.126573 kernel:   Device   empty
Oct 19 14:32:17.126581 kernel: Movable zone start for each node
Oct 19 14:32:17.126588 kernel: Early memory node ranges
Oct 19 14:32:17.126596 kernel:   node   0: [mem 0x0000000000001000-0x000000000009ffff]
Oct 19 14:32:17.126604 kernel:   node   0: [mem 0x0000000000100000-0x00000000044fdfff]
Oct 19 14:32:17.126612 kernel:   node   0: [mem 0x00000000048fe000-0x000000003ff1efff]
Oct 19 14:32:17.126620 kernel:   node   0: [mem 0x000000003ffff000-0x000000003fffffff]
Oct 19 14:32:17.126628 kernel:   node   0: [mem 0x0000000100000000-0x00000002bfffffff]
Oct 19 14:32:17.126638 kernel: Initmem setup node 0 [mem 0x0000000000001000-0x00000002bfffffff]
Oct 19 14:32:17.126646 kernel: On node 0, zone DMA: 1 pages in unavailable ranges
Oct 19 14:32:17.126654 kernel: On node 0, zone DMA: 96 pages in unavailable ranges
Oct 19 14:32:17.126662 kernel: On node 0, zone DMA32: 1024 pages in unavailable ranges
Oct 19 14:32:17.126670 kernel: On node 0, zone DMA32: 224 pages in unavailable ranges
Oct 19 14:32:17.126678 kernel: ACPI: PM-Timer IO Port: 0x408
Oct 19 14:32:17.126686 kernel: ACPI: LAPIC_NMI (acpi_id[0x01] dfl dfl lint[0x1])
Oct 19 14:32:17.126697 kernel: IOAPIC[0]: apic_id 0, version 17, address 0xfec00000, GSI 0-23
Oct 19 14:32:17.126704 kernel: ACPI: INT_SRC_OVR (bus 0 bus_irq 9 global_irq 9 high level)
Oct 19 14:32:17.126712 kernel: ACPI: Using ACPI (MADT) for SMP configuration information
Oct 19 14:32:17.126721 kernel: ACPI: SPCR: console: uart,io,0x3f8,115200
Oct 19 14:32:17.126729 kernel: TSC deadline timer available
Oct 19 14:32:17.126738 kernel: CPU topo: Max. logical packages:   1
Oct 19 14:32:17.126746 kernel: CPU topo: Max. logical dies:       1
Oct 19 14:32:17.126762 kernel: CPU topo: Max. dies per package:   1
Oct 19 14:32:17.126771 kernel: CPU topo: Max. threads per core:   2
Oct 19 14:32:17.126778 kernel: CPU topo: Num. cores per package:     1
Oct 19 14:32:17.126786 kernel: CPU topo: Num. threads per package:   2
Oct 19 14:32:17.126794 kernel: CPU topo: Allowing 2 present CPUs plus 0 hotplug CPUs
Oct 19 14:32:17.126801 kernel: [mem 0x40000000-0xffffffff] available for PCI devices
Oct 19 14:32:17.126809 kernel: Booting paravirtualized kernel on Hyper-V
Oct 19 14:32:17.126819 kernel: clocksource: refined-jiffies: mask: 0xffffffff max_cycles: 0xffffffff, max_idle_ns: 1910969940391419 ns
Oct 19 14:32:17.126826 kernel: setup_percpu: NR_CPUS:512 nr_cpumask_bits:2 nr_cpu_ids:2 nr_node_ids:1
Oct 19 14:32:17.126835 kernel: percpu: Embedded 56 pages/cpu s191128 r8192 d30056 u1048576
Oct 19 14:32:17.126843 kernel: pcpu-alloc: s191128 r8192 d30056 u1048576 alloc=1*2097152
Oct 19 14:32:17.126851 kernel: pcpu-alloc: [0] 0 1 
Oct 19 14:32:17.126858 kernel: Hyper-V: PV spinlocks enabled
Oct 19 14:32:17.126867 kernel: PV qspinlock hash table entries: 256 (order: 0, 4096 bytes, linear)
Oct 19 14:32:17.126880 kernel: Kernel command line: rootflags=rw mount.usrflags=ro BOOT_IMAGE=/flatcar/vmlinuz-a mount.usr=/dev/mapper/usr verity.usr=PARTUUID=7130c94a-213a-4e5a-8e26-6cce9662f132 rootflags=rw mount.usrflags=ro consoleblank=0 root=LABEL=ROOT console=tty1 console=ttyS0,115200n8 earlyprintk=ttyS0,115200 flatcar.first_boot=detected flatcar.oem.id=azure flatcar.autologin verity.usrhash=1965178a28db43350a0cd55c710101aee06f10df191fb062190e930135599d4e
Oct 19 14:32:17.126889 kernel: printk: log buffer data + meta data: 262144 + 917504 = 1179648 bytes
Oct 19 14:32:17.126897 kernel: Dentry cache hash table entries: 1048576 (order: 11, 8388608 bytes, linear)
Oct 19 14:32:17.126905 kernel: Inode-cache hash table entries: 524288 (order: 10, 4194304 bytes, linear)
Oct 19 14:32:17.126913 kernel: software IO TLB: area num 2.
Oct 19 14:32:17.126921 kernel: Fallback order for Node 0: 0 
Oct 19 14:32:17.126929 kernel: Built 1 zonelists, mobility grouping on.  Total pages: 2095807
Oct 19 14:32:17.126939 kernel: Policy zone: Normal
Oct 19 14:32:17.126948 kernel: mem auto-init: stack:off, heap alloc:off, heap free:off
Oct 19 14:32:17.126957 kernel: SLUB: HWalign=64, Order=0-3, MinObjects=0, CPUs=2, Nodes=1
Oct 19 14:32:17.126966 kernel: ftrace: allocating 42928 entries in 168 pages
Oct 19 14:32:17.126975 kernel: ftrace: allocated 168 pages with 3 groups
Oct 19 14:32:17.126983 kernel: Dynamic Preempt: voluntary
Oct 19 14:32:17.126991 kernel: rcu: Preemptible hierarchical RCU implementation.
Oct 19 14:32:17.127009 kernel: rcu:         RCU event tracing is enabled.
Oct 19 14:32:17.127018 kernel: rcu:         RCU restricting CPUs from NR_CPUS=512 to nr_cpu_ids=2.
Oct 19 14:32:17.127029 kernel:         Trampoline variant of Tasks RCU enabled.
Oct 19 14:32:17.127038 kernel:         Rude variant of Tasks RCU enabled.
Oct 19 14:32:17.127047 kernel:         Tracing variant of Tasks RCU enabled.
Oct 19 14:32:17.127057 kernel: rcu: RCU calculated value of scheduler-enlistment delay is 100 jiffies.
Oct 19 14:32:17.127065 kernel: rcu: Adjusting geometry for rcu_fanout_leaf=16, nr_cpu_ids=2
Oct 19 14:32:17.127074 kernel: RCU Tasks: Setting shift to 1 and lim to 1 rcu_task_cb_adjust=1 rcu_task_cpu_ids=2.
Oct 19 14:32:17.127101 kernel: RCU Tasks Rude: Setting shift to 1 and lim to 1 rcu_task_cb_adjust=1 rcu_task_cpu_ids=2.
Oct 19 14:32:17.127113 kernel: RCU Tasks Trace: Setting shift to 1 and lim to 1 rcu_task_cb_adjust=1 rcu_task_cpu_ids=2.
Oct 19 14:32:17.127123 kernel: Using NULL legacy PIC
Oct 19 14:32:17.127132 kernel: NR_IRQS: 33024, nr_irqs: 440, preallocated irqs: 0
Oct 19 14:32:17.127140 kernel: rcu: srcu_init: Setting srcu_struct sizes based on contention.
Oct 19 14:32:17.127151 kernel: clocksource: jiffies: mask: 0xffffffff max_cycles: 0xffffffff, max_idle_ns: 1911260446275000 ns
Oct 19 14:32:17.127160 kernel: Console: colour dummy device 80x25
Oct 19 14:32:17.127169 kernel: printk: legacy console [tty1] enabled
Oct 19 14:32:17.127178 kernel: printk: legacy console [ttyS0] enabled
Oct 19 14:32:17.127187 kernel: printk: legacy bootconsole [earlyser0] disabled
Oct 19 14:32:17.127196 kernel: ACPI: Core revision 20250807
Oct 19 14:32:17.127205 kernel: Failed to register legacy timer interrupt
Oct 19 14:32:17.127215 kernel: APIC: Switch to symmetric I/O mode setup
Oct 19 14:32:17.127224 kernel: x2apic enabled
Oct 19 14:32:17.127233 kernel: APIC: Switched APIC routing to: physical x2apic
Oct 19 14:32:17.127242 kernel: Hyper-V: Host Build 10.0.26102.3669-3-0
Oct 19 14:32:17.127251 kernel: Hyper-V: enabling crash_kexec_post_notifiers
Oct 19 14:32:17.127261 kernel: Hyper-V: Using IPI hypercalls
Oct 19 14:32:17.127270 kernel: APIC: send_IPI() replaced with hv_send_ipi()
Oct 19 14:32:17.127281 kernel: APIC: send_IPI_mask() replaced with hv_send_ipi_mask()
Oct 19 14:32:17.127289 kernel: APIC: send_IPI_mask_allbutself() replaced with hv_send_ipi_mask_allbutself()
Oct 19 14:32:17.127298 kernel: APIC: send_IPI_allbutself() replaced with hv_send_ipi_allbutself()
Oct 19 14:32:17.127307 kernel: APIC: send_IPI_all() replaced with hv_send_ipi_all()
Oct 19 14:32:17.127316 kernel: APIC: send_IPI_self() replaced with hv_send_ipi_self()
Oct 19 14:32:17.127325 kernel: clocksource: tsc-early: mask: 0xffffffffffffffff max_cycles: 0x212735f0517, max_idle_ns: 440795237604 ns
Oct 19 14:32:17.127335 kernel: Calibrating delay loop (skipped), value calculated using timer frequency.. 4600.00 BogoMIPS (lpj=2300001)
Oct 19 14:32:17.127346 kernel: x86/cpu: User Mode Instruction Prevention (UMIP) activated
Oct 19 14:32:17.127355 kernel: CET detected: Indirect Branch Tracking enabled
Oct 19 14:32:17.127363 kernel: Last level iTLB entries: 4KB 0, 2MB 0, 4MB 0
Oct 19 14:32:17.127371 kernel: Last level dTLB entries: 4KB 0, 2MB 0, 4MB 0, 1GB 0
Oct 19 14:32:17.127380 kernel: mitigations: Enabled attack vectors: user_kernel, user_user, guest_host, guest_guest, SMT mitigations: auto
Oct 19 14:32:17.127388 kernel: Speculative Store Bypass: Vulnerable
Oct 19 14:32:17.127396 kernel: Spectre V2 : Mitigation: Retpolines
Oct 19 14:32:17.127404 kernel: RETBleed: Vulnerable
Oct 19 14:32:17.127412 kernel: ITS: Mitigation: Aligned branch/return thunks
Oct 19 14:32:17.127421 kernel: Spectre V1 : Mitigation: usercopy/swapgs barriers and __user pointer sanitization
Oct 19 14:32:17.127432 kernel: Spectre V2 : Spectre v2 / SpectreRSB: Filling RSB on context switch and VMEXIT
Oct 19 14:32:17.127440 kernel: active return thunk: its_return_thunk
Oct 19 14:32:17.127449 kernel: x86/fpu: Supporting XSAVE feature 0x001: 'x87 floating point registers'
Oct 19 14:32:17.127456 kernel: x86/fpu: Supporting XSAVE feature 0x002: 'SSE registers'
Oct 19 14:32:17.127465 kernel: x86/fpu: Supporting XSAVE feature 0x004: 'AVX registers'
Oct 19 14:32:17.127473 kernel: x86/fpu: Supporting XSAVE feature 0x020: 'AVX-512 opmask'
Oct 19 14:32:17.127482 kernel: x86/fpu: Supporting XSAVE feature 0x040: 'AVX-512 Hi256'
Oct 19 14:32:17.127490 kernel: x86/fpu: Supporting XSAVE feature 0x080: 'AVX-512 ZMM_Hi256'
Oct 19 14:32:17.127498 kernel: x86/fpu: Supporting XSAVE feature 0x800: 'Control-flow User registers'
Oct 19 14:32:17.127507 kernel: x86/fpu: Supporting XSAVE feature 0x1000: 'Control-flow Kernel registers (KVM only)'
Oct 19 14:32:17.127518 kernel: x86/fpu: Supporting XSAVE feature 0x20000: 'AMX Tile config'
Oct 19 14:32:17.127526 kernel: x86/fpu: Supporting XSAVE feature 0x40000: 'AMX Tile data'
Oct 19 14:32:17.127534 kernel: x86/fpu: xstate_offset[2]:  576, xstate_sizes[2]:  256
Oct 19 14:32:17.127542 kernel: x86/fpu: xstate_offset[5]:  832, xstate_sizes[5]:   64
Oct 19 14:32:17.127550 kernel: x86/fpu: xstate_offset[6]:  896, xstate_sizes[6]:  512
Oct 19 14:32:17.127558 kernel: x86/fpu: xstate_offset[7]: 1408, xstate_sizes[7]: 1024
Oct 19 14:32:17.127566 kernel: x86/fpu: xstate_offset[11]: 2432, xstate_sizes[11]:   16
Oct 19 14:32:17.127575 kernel: x86/fpu: xstate_offset[12]: 2448, xstate_sizes[12]:   24
Oct 19 14:32:17.127583 kernel: x86/fpu: xstate_offset[17]: 2496, xstate_sizes[17]:   64
Oct 19 14:32:17.127592 kernel: x86/fpu: xstate_offset[18]: 2560, xstate_sizes[18]: 8192
Oct 19 14:32:17.127601 kernel: x86/fpu: Enabled xstate features 0x618e7, context size is 10752 bytes, using 'compacted' format.
Oct 19 14:32:17.127611 kernel: Freeing SMP alternatives memory: 40K
Oct 19 14:32:17.127619 kernel: pid_max: default: 32768 minimum: 301
Oct 19 14:32:17.127627 kernel: LSM: initializing lsm=lockdown,capability,landlock,selinux,ima
Oct 19 14:32:17.127635 kernel: landlock: Up and running.
Oct 19 14:32:17.127643 kernel: SELinux:  Initializing.
Oct 19 14:32:17.127652 kernel: Mount-cache hash table entries: 16384 (order: 5, 131072 bytes, linear)
Oct 19 14:32:17.127660 kernel: Mountpoint-cache hash table entries: 16384 (order: 5, 131072 bytes, linear)
Oct 19 14:32:17.127669 kernel: smpboot: CPU0: Intel INTEL(R) XEON(R) PLATINUM 8573C (family: 0x6, model: 0xcf, stepping: 0x2)
Oct 19 14:32:17.127678 kernel: Performance Events: unsupported CPU family 6 model 207 no PMU driver, software events only.
Oct 19 14:32:17.127687 kernel: signal: max sigframe size: 11952
Oct 19 14:32:17.127697 kernel: rcu: Hierarchical SRCU implementation.
Oct 19 14:32:17.127706 kernel: rcu:         Max phase no-delay instances is 400.
Oct 19 14:32:17.127715 kernel: Timer migration: 1 hierarchy levels; 8 children per group; 1 crossnode level
Oct 19 14:32:17.127724 kernel: NMI watchdog: Perf NMI watchdog permanently disabled
Oct 19 14:32:17.127734 kernel: smp: Bringing up secondary CPUs ...
Oct 19 14:32:17.127743 kernel: smpboot: x86: Booting SMP configuration:
Oct 19 14:32:17.127752 kernel: .... node  #0, CPUs:      #1
Oct 19 14:32:17.127763 kernel: smp: Brought up 1 node, 2 CPUs
Oct 19 14:32:17.127772 kernel: smpboot: Total of 2 processors activated (9200.00 BogoMIPS)
Oct 19 14:32:17.127781 kernel: Memory: 8055220K/8383228K available (14461K kernel code, 2497K rwdata, 33760K rodata, 16452K init, 1384K bss, 322716K reserved, 0K cma-reserved)
Oct 19 14:32:17.127790 kernel: devtmpfs: initialized
Oct 19 14:32:17.127799 kernel: x86/mm: Memory block size: 128MB
Oct 19 14:32:17.127808 kernel: ACPI: PM: Registering ACPI NVS region [mem 0x3fffb000-0x3fffefff] (16384 bytes)
Oct 19 14:32:17.127817 kernel: posixtimers hash table entries: 1024 (order: 2, 16384 bytes, linear)
Oct 19 14:32:17.127828 kernel: futex hash table entries: 512 (32768 bytes on 1 NUMA nodes, total 32 KiB, linear).
Oct 19 14:32:17.127837 kernel: pinctrl core: initialized pinctrl subsystem
Oct 19 14:32:17.127846 kernel: NET: Registered PF_NETLINK/PF_ROUTE protocol family
Oct 19 14:32:17.127855 kernel: audit: initializing netlink subsys (disabled)
Oct 19 14:32:17.127863 kernel: audit: type=2000 audit(1792420330.110:1): state=initialized audit_enabled=0 res=1
Oct 19 14:32:17.127872 kernel: thermal_sys: Registered thermal governor 'step_wise'
Oct 19 14:32:17.127882 kernel: cpuidle: using governor menu
Oct 19 14:32:17.127893 kernel: efi: Freeing EFI boot services memory: 35048K
Oct 19 14:32:17.127902 kernel: acpiphp: ACPI Hot Plug PCI Controller Driver version: 0.5
Oct 19 14:32:17.127910 kernel: dca service started, version 1.12.1
Oct 19 14:32:17.127919 kernel: e820: reserve RAM buffer [mem 0x044fe000-0x07ffffff]
Oct 19 14:32:17.127927 kernel: e820: reserve RAM buffer [mem 0x3ff1f000-0x3fffffff]
Oct 19 14:32:17.127958 kernel: kprobes: kprobe jump-optimization is enabled. All kprobes are optimized if possible.
Oct 19 14:32:17.127969 kernel: HugeTLB: registered 1.00 GiB page size, pre-allocated 0 pages
Oct 19 14:32:17.127980 kernel: HugeTLB: 16380 KiB vmemmap can be freed for a 1.00 GiB page
Oct 19 14:32:17.127989 kernel: HugeTLB: registered 2.00 MiB page size, pre-allocated 0 pages
Oct 19 14:32:17.127998 kernel: HugeTLB: 28 KiB vmemmap can be freed for a 2.00 MiB page
Oct 19 14:32:17.128007 kernel: ACPI: Added _OSI(Module Device)
Oct 19 14:32:17.128015 kernel: ACPI: Added _OSI(Processor Device)
Oct 19 14:32:17.128025 kernel: ACPI: Added _OSI(Processor Aggregator Device)
Oct 19 14:32:17.128034 kernel: ACPI: 1 ACPI AML tables successfully acquired and loaded
Oct 19 14:32:17.128045 kernel: ACPI: Interpreter enabled
Oct 19 14:32:17.128054 kernel: ACPI: PM: (supports S0 S5)
Oct 19 14:32:17.128062 kernel: ACPI: Using IOAPIC for interrupt routing
Oct 19 14:32:17.128071 kernel: PCI: Using host bridge windows from ACPI; if necessary, use "pci=nocrs" and report a bug
Oct 19 14:32:17.132506 kernel: PCI: Ignoring E820 reservations for host bridge windows
Oct 19 14:32:17.132530 kernel: ACPI: Enabled 1 GPEs in block 00 to 0F
Oct 19 14:32:17.132540 kernel: iommu: Default domain type: Translated
Oct 19 14:32:17.132554 kernel: iommu: DMA domain TLB invalidation policy: lazy mode
Oct 19 14:32:17.132563 kernel: efivars: Registered efivars operations
Oct 19 14:32:17.132573 kernel: PCI: Using ACPI for IRQ routing
Oct 19 14:32:17.132582 kernel: PCI: System does not support PCI
Oct 19 14:32:17.132592 kernel: vgaarb: loaded
Oct 19 14:32:17.132601 kernel: clocksource: Switched to clocksource tsc-early
Oct 19 14:32:17.132610 kernel: VFS: Disk quotas dquot_6.6.0
Oct 19 14:32:17.132620 kernel: VFS: Dquot-cache hash table entries: 512 (order 0, 4096 bytes)
Oct 19 14:32:17.132632 kernel: pnp: PnP ACPI init
Oct 19 14:32:17.132641 kernel: pnp: PnP ACPI: found 3 devices
Oct 19 14:32:17.132651 kernel: clocksource: acpi_pm: mask: 0xffffff max_cycles: 0xffffff, max_idle_ns: 2085701024 ns
Oct 19 14:32:17.132660 kernel: NET: Registered PF_INET protocol family
Oct 19 14:32:17.132669 kernel: IP idents hash table entries: 131072 (order: 8, 1048576 bytes, linear)
Oct 19 14:32:17.132679 kernel: tcp_listen_portaddr_hash hash table entries: 4096 (order: 4, 65536 bytes, linear)
Oct 19 14:32:17.132688 kernel: Table-perturb hash table entries: 65536 (order: 6, 262144 bytes, linear)
Oct 19 14:32:17.132700 kernel: TCP established hash table entries: 65536 (order: 7, 524288 bytes, linear)
Oct 19 14:32:17.132709 kernel: TCP bind hash table entries: 65536 (order: 9, 2097152 bytes, linear)
Oct 19 14:32:17.132719 kernel: TCP: Hash tables configured (established 65536 bind 65536)
Oct 19 14:32:17.132727 kernel: UDP hash table entries: 4096 (order: 6, 262144 bytes, linear)
Oct 19 14:32:17.132736 kernel: UDP-Lite hash table entries: 4096 (order: 6, 262144 bytes, linear)
Oct 19 14:32:17.132745 kernel: NET: Registered PF_UNIX/PF_LOCAL protocol family
Oct 19 14:32:17.132755 kernel: NET: Registered PF_XDP protocol family
Oct 19 14:32:17.132766 kernel: PCI: CLS 0 bytes, default 64
Oct 19 14:32:17.132776 kernel: PCI-DMA: Using software bounce buffering for IO (SWIOTLB)
Oct 19 14:32:17.132785 kernel: software IO TLB: mapped [mem 0x000000003a96c000-0x000000003e96c000] (64MB)
Oct 19 14:32:17.132794 kernel: RAPL PMU: API unit is 2^-32 Joules, 1 fixed counters, 10737418240 ms ovfl timer
Oct 19 14:32:17.132803 kernel: RAPL PMU: hw unit of domain psys 2^-0 Joules
Oct 19 14:32:17.132812 kernel: clocksource: tsc: mask: 0xffffffffffffffff max_cycles: 0x212735f0517, max_idle_ns: 440795237604 ns
Oct 19 14:32:17.132821 kernel: clocksource: Switched to clocksource tsc
Oct 19 14:32:17.132833 kernel: Initialise system trusted keyrings
Oct 19 14:32:17.132842 kernel: workingset: timestamp_bits=39 max_order=21 bucket_order=0
Oct 19 14:32:17.132852 kernel: Key type asymmetric registered
Oct 19 14:32:17.132861 kernel: Asymmetric key parser 'x509' registered
Oct 19 14:32:17.132870 kernel: Block layer SCSI generic (bsg) driver version 0.4 loaded (major 250)
Oct 19 14:32:17.132879 kernel: io scheduler mq-deadline registered
Oct 19 14:32:17.132888 kernel: io scheduler kyber registered
Oct 19 14:32:17.132899 kernel: io scheduler bfq registered
Oct 19 14:32:17.132909 kernel: ioatdma: Intel(R) QuickData Technology Driver 5.00
Oct 19 14:32:17.132919 kernel: Serial: 8250/16550 driver, 4 ports, IRQ sharing enabled
Oct 19 14:32:17.132928 kernel: 00:00: ttyS0 at I/O 0x3f8 (irq = 4, base_baud = 115200) is a 16550A
Oct 19 14:32:17.132938 kernel: 00:01: ttyS1 at I/O 0x2f8 (irq = 3, base_baud = 115200) is a 16550A
Oct 19 14:32:17.132947 kernel: serial8250: ttyS2 at I/O 0x3e8 (irq = 4, base_baud = 115200) is a 16550A
Oct 19 14:32:17.132956 kernel: ACPI: bus type drm_connector registered
Oct 19 14:32:17.132967 kernel: i8042: PNP: No PS/2 controller found.
Oct 19 14:32:17.133174 kernel: rtc_cmos 00:02: registered as rtc0
Oct 19 14:32:17.133289 kernel: rtc_cmos 00:02: setting system clock to 2026-10-19T14:32:10 UTC (1792420330)
Oct 19 14:32:17.133393 kernel: rtc_cmos 00:02: alarms up to one month, 114 bytes nvram
Oct 19 14:32:17.133405 kernel: intel_pstate: Intel P-state driver initializing
Oct 19 14:32:17.133416 kernel: efifb: probing for efifb
Oct 19 14:32:17.133429 kernel: efifb: framebuffer at 0x40000000, using 3072k, total 3072k
Oct 19 14:32:17.133438 kernel: efifb: mode is 1024x768x32, linelength=4096, pages=1
Oct 19 14:32:17.133448 kernel: efifb: scrolling: redraw
Oct 19 14:32:17.133457 kernel: efifb: Truecolor: size=8:8:8:8, shift=24:16:8:0
Oct 19 14:32:17.133467 kernel: Console: switching to colour frame buffer device 128x48
Oct 19 14:32:17.133476 kernel: fb0: EFI VGA frame buffer device
Oct 19 14:32:17.133486 kernel: pstore: Using crash dump compression: deflate
Oct 19 14:32:17.133497 kernel: pstore: Registered efi_pstore as persistent store backend
Oct 19 14:32:17.133506 kernel: NET: Registered PF_INET6 protocol family
Oct 19 14:32:17.133515 kernel: Segment Routing with IPv6
Oct 19 14:32:17.133524 kernel: In-situ OAM (IOAM) with IPv6
Oct 19 14:32:17.133534 kernel: NET: Registered PF_PACKET protocol family
Oct 19 14:32:17.133543 kernel: Key type dns_resolver registered
Oct 19 14:32:17.133553 kernel: IPI shorthand broadcast: enabled
Oct 19 14:32:17.133564 kernel: sched_clock: Marking stable (1130005195, 96288209)->(1524512437, -298219033)
Oct 19 14:32:17.133574 kernel: registered taskstats version 1
Oct 19 14:32:17.133583 kernel: Loading compiled-in X.509 certificates
Oct 19 14:32:17.133594 kernel: Loaded X.509 cert 'Kinvolk GmbH: Module signing key for 6.18.45-flatcar: 8e2219fd554447c404622029bcad7671e6871b6f'
Oct 19 14:32:17.133603 kernel: Demotion targets for Node 0: null
Oct 19 14:32:17.133613 kernel: Key type .fscrypt registered
Oct 19 14:32:17.133622 kernel: Key type fscrypt-provisioning registered
Oct 19 14:32:17.133633 kernel: ima: No TPM chip found, activating TPM-bypass!
Oct 19 14:32:17.133643 kernel: ima: Allocated hash algorithm: sha1
Oct 19 14:32:17.133653 kernel: ima: No architecture policies found
Oct 19 14:32:17.133663 kernel: clk: Disabling unused clocks
Oct 19 14:32:17.133673 kernel: Freeing unused kernel image (initmem) memory: 16452K
Oct 19 14:32:17.133682 kernel: Write protecting the kernel read-only data: 51200k
Oct 19 14:32:17.133692 kernel: Freeing unused kernel image (text/rodata gap) memory: 1920K
Oct 19 14:32:17.133702 kernel: Freeing unused kernel image (rodata/data gap) memory: 1056K
Oct 19 14:32:17.133713 kernel: Run /init as init process
Oct 19 14:32:17.133722 kernel:   with arguments:
Oct 19 14:32:17.133732 kernel:     /init
Oct 19 14:32:17.133742 kernel:   with environment:
Oct 19 14:32:17.133751 kernel:     HOME=/
Oct 19 14:32:17.133760 kernel:     TERM=linux
Oct 19 14:32:17.133770 kernel: hv_vmbus: hv_mmio=[mem 0x40000000-0xfed3ffff],[mem 0xfc0000000-0xfffffffff] fb=[mem 0x40000000-0x47ffffff]
Oct 19 14:32:17.133782 kernel: hv_vmbus: Vmbus version:5.3
Oct 19 14:32:17.133791 kernel: pps_core: LinuxPPS API ver. 1 registered
Oct 19 14:32:17.133802 kernel: pps_core: Software ver. 5.3.6 - Copyright 2005-2007 Rodolfo Giometti <giometti@linux.it>
Oct 19 14:32:17.133811 kernel: PTP clock support registered
Oct 19 14:32:17.133821 kernel: hv_utils: Registering HyperV Utility Driver
Oct 19 14:32:17.133831 kernel: SCSI subsystem initialized
Oct 19 14:32:17.133841 kernel: hv_vmbus: registering driver hv_utils
Oct 19 14:32:17.133852 kernel: hv_utils: Shutdown IC version 3.2
Oct 19 14:32:17.133862 kernel: hv_utils: Heartbeat IC version 3.0
Oct 19 14:32:17.133871 kernel: hv_utils: TimeSync IC version 4.0
Oct 19 14:32:17.133881 kernel: hv_vmbus: registering driver hv_pci
Oct 19 14:32:17.134038 kernel: hv_pci 7ad35d50-c05b-47ab-b3a0-56a9a845852b: PCI VMBus probing: Using version 0x10004
Oct 19 14:32:17.134182 kernel: hv_pci 7ad35d50-c05b-47ab-b3a0-56a9a845852b: PCI host bridge to bus c05b:00
Oct 19 14:32:17.134334 kernel: pci_bus c05b:00: root bus resource [mem 0xfc0000000-0xfc007ffff window]
Oct 19 14:32:17.134457 kernel: pci_bus c05b:00: No busn resource found for root bus, will use [bus 00-ff]
Oct 19 14:32:17.134607 kernel: pci c05b:00:00.0: [1414:00a9] type 00 class 0x010802 PCIe Endpoint
Oct 19 14:32:17.134741 kernel: pci c05b:00:00.0: BAR 0 [mem 0xfc0000000-0xfc007ffff 64bit]
Oct 19 14:32:17.134864 kernel: pci_bus c05b:00: busn_res: [bus 00-ff] end is updated to 00
Oct 19 14:32:17.135003 kernel: pci c05b:00:00.0: BAR 0 [mem 0xfc0000000-0xfc007ffff 64bit]: assigned
Oct 19 14:32:17.135013 kernel: hv_vmbus: registering driver hv_storvsc
Oct 19 14:32:17.135159 kernel: scsi host0: storvsc_host_t
Oct 19 14:32:17.135304 kernel: scsi 0:0:0:2: CD-ROM            Msft     Virtual DVD-ROM  1.0  PQ: 0 ANSI: 5
Oct 19 14:32:17.135316 kernel: hid: raw HID events driver (C) Jiri Kosina
Oct 19 14:32:17.135324 kernel: hv_vmbus: registering driver hid_hyperv
Oct 19 14:32:17.135337 kernel: input: Microsoft Vmbus HID-compliant Mouse as /devices/0006:045E:0621.0001/input/input0
Oct 19 14:32:17.135447 kernel: hid-hyperv 0006:045E:0621.0001: input: VIRTUAL HID v0.01 Mouse [Microsoft Vmbus HID-compliant Mouse] on 
Oct 19 14:32:17.135459 kernel: hv_vmbus: registering driver hyperv_keyboard
Oct 19 14:32:17.135468 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
Oct 19 14:32:17.135598 kernel: nvme nvme0: pci function c05b:00:00.0
Oct 19 14:32:17.135734 kernel: nvme c05b:00:00.0: enabling device (0000 -> 0002)
Oct 19 14:32:17.135849 kernel: nvme nvme0: 2/0/0 default/read/poll queues
Oct 19 14:32:17.135863 kernel:  nvme0n1: p1 p2 p3 p4 p6 p7 p9
Oct 19 14:32:17.136005 kernel: sr 0:0:0:2: [sr0] scsi-1 drive
Oct 19 14:32:17.136019 kernel: cdrom: Uniform CD-ROM driver Revision: 3.20
Oct 19 14:32:17.136158 kernel: sr 0:0:0:2: Attached scsi CD-ROM sr0
Oct 19 14:32:17.136171 kernel: device-mapper: core: CONFIG_IMA_DISABLE_HTABLE is disabled. Duplicate IMA measurements will not be recorded in the IMA log.
Oct 19 14:32:17.136183 kernel: device-mapper: uevent: version 1.0.3
Oct 19 14:32:17.136191 kernel: device-mapper: ioctl: 4.50.0-ioctl (2025-04-28) initialised: dm-devel@lists.linux.dev
Oct 19 14:32:17.136201 kernel: device-mapper: verity: sha256 using "sha256-lib"
Oct 19 14:32:17.136210 kernel: raid6: avx512x4 gen() 44449 MB/s
Oct 19 14:32:17.136219 kernel: raid6: avx512x2 gen() 43959 MB/s
Oct 19 14:32:17.136229 kernel: raid6: avx512x1 gen() 25741 MB/s
Oct 19 14:32:17.136238 kernel: raid6: avx2x4   gen() 36660 MB/s
Oct 19 14:32:17.136249 kernel: raid6: avx2x2   gen() 38452 MB/s
Oct 19 14:32:17.136258 kernel: raid6: avx2x1   gen() 30684 MB/s
Oct 19 14:32:17.136267 kernel: raid6: using algorithm avx512x4 gen() 44449 MB/s
Oct 19 14:32:17.136276 kernel: raid6: .... xor() 7695 MB/s, rmw enabled
Oct 19 14:32:17.136285 kernel: raid6: using avx512x2 recovery algorithm
Oct 19 14:32:17.136295 kernel: xor: automatically using best checksumming function   avx       
Oct 19 14:32:17.136305 kernel: Btrfs loaded, zoned=no, fsverity=no
Oct 19 14:32:17.136316 kernel: BTRFS: device fsid ec442512-55cc-4be3-90bb-d89873364c56 devid 1 transid 39 /dev/mapper/usr (254:0) scanned by mount (956)
Oct 19 14:32:17.136326 kernel: BTRFS info (device dm-0): first mount of filesystem ec442512-55cc-4be3-90bb-d89873364c56
Oct 19 14:32:17.136335 kernel: BTRFS info (device dm-0): using crc32c (crc32c-lib) checksum algorithm
Oct 19 14:32:17.136344 kernel: BTRFS info (device dm-0 state E): enabling ssd optimizations
Oct 19 14:32:17.136353 kernel: BTRFS info (device dm-0 state E): disabling log replay at mount time
Oct 19 14:32:17.136363 kernel: BTRFS info (device dm-0 state E): enabling free space tree
Oct 19 14:32:17.136372 kernel: loop: module loaded
Oct 19 14:32:17.136384 kernel: loop0: detected capacity change from 0 to 111936
Oct 19 14:32:17.136393 kernel: squashfs: version 4.0 (2009/01/31) Phillip Lougher
Oct 19 14:32:17.136403 systemd[1]: Successfully made /usr/ read-only.
Oct 19 14:32:17.136416 systemd[1]: systemd 261.2 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)
Oct 19 14:32:17.136426 systemd[1]: Detected virtualization microsoft.
Oct 19 14:32:17.136436 systemd[1]: Detected architecture x86-64.
Oct 19 14:32:17.136448 systemd[1]: Running in initrd.
Oct 19 14:32:17.136458 systemd[1]: Initializing machine ID from random generator.
Oct 19 14:32:17.136469 systemd[1]: No hostname configured, using default hostname.
Oct 19 14:32:17.136478 systemd[1]: Hostname set to <localhost>.
Oct 19 14:32:17.136489 systemd[1]: Queued start job for default target initrd.target.
Oct 19 14:32:17.136499 systemd[1]: Started clevis-luks-askpass.path - Forward Password Requests to Clevis Directory Watch.
Oct 19 14:32:17.136509 systemd[1]: Started systemd-ask-password-console.path - Dispatch Password Requests to Console Directory Watch.
Oct 19 14:32:17.136521 systemd[1]: Expecting device dev-disk-by\x2dlabel-EFI\x2dSYSTEM.device - /dev/disk/by-label/EFI-SYSTEM...
Oct 19 14:32:17.136531 systemd[1]: Expecting device dev-disk-by\x2dlabel-OEM.device - /dev/disk/by-label/OEM...
Oct 19 14:32:17.136540 systemd[1]: Expecting device dev-disk-by\x2dlabel-ROOT.device - /dev/disk/by-label/ROOT...
Oct 19 14:32:17.136552 systemd[1]: Expecting device dev-disk-by\x2dpartlabel-USR\x2dA.device - /dev/disk/by-partlabel/USR-A...
Oct 19 14:32:17.136562 systemd[1]: Expecting device dev-mapper-usr.device - /dev/mapper/usr...
Oct 19 14:32:17.136572 systemd[1]: Reached target cryptsetup-pre.target - Local Encrypted Volumes (Pre).
Oct 19 14:32:17.136583 systemd[1]: Reached target cryptsetup.target - Local Encrypted Volumes.
Oct 19 14:32:17.136593 systemd[1]: Reached target initrd-usr-fs.target - Initrd /usr File System.
Oct 19 14:32:17.136603 systemd[1]: Reached target paths.target - Path Units.
Oct 19 14:32:17.136615 systemd[1]: Reached target slices.target - Slice Units.
Oct 19 14:32:17.136624 systemd[1]: Reached target swap.target - Swaps.
Oct 19 14:32:17.136633 systemd[1]: Reached target timers.target - Timer Units.
Oct 19 14:32:17.136643 systemd[1]: Listening on iscsid.socket - Open-iSCSI iscsid Socket.
Oct 19 14:32:17.136652 systemd[1]: Listening on iscsiuio.socket - Open-iSCSI iscsiuio Socket.
Oct 19 14:32:17.136661 systemd[1]: Listening on systemd-coredump.socket - Process Core Dump Socket.
Oct 19 14:32:17.136671 systemd[1]: Listening on systemd-journald-audit.socket - Journal Audit Socket.
Oct 19 14:32:17.136681 systemd[1]: Listening on systemd-journald-dev-log.socket - Journal Socket (/dev/log).
Oct 19 14:32:17.136692 systemd[1]: Listening on systemd-journald.socket - Journal Sockets.
Oct 19 14:32:17.136701 systemd[1]: Listening on systemd-networkd.socket - Network Management Netlink Socket.
Oct 19 14:32:17.136711 systemd[1]: Listening on systemd-udevd-control.socket - udev Control Socket.
Oct 19 14:32:17.136720 systemd[1]: Listening on systemd-udevd-kernel.socket - udev Kernel Socket.
Oct 19 14:32:17.136735 systemd[1]: Listening on systemd-udevd-varlink.socket - udev Varlink Socket.
Oct 19 14:32:17.136745 systemd[1]: Reached target sockets.target - Socket Units.
Oct 19 14:32:17.136757 systemd[1]: afterburn-network-kargs.service - Afterburn Initrd Setup Network Kernel Arguments skipped, no trigger condition checks were met.
Oct 19 14:32:17.136767 systemd[1]: Starting ignition-setup-pre.service - Ignition env setup...
Oct 19 14:32:17.136776 systemd[1]: Starting kmod-static-nodes.service - Create List of Static Device Nodes...
Oct 19 14:32:17.136785 systemd[1]: Finished network-cleanup.service - Network Cleanup.
Oct 19 14:32:17.136795 systemd[1]: systemd-battery-check.service - Early Battery Level Check skipped, unmet condition check ConditionDirectoryNotEmpty=/sys/class/power_supply
Oct 19 14:32:17.136810 systemd[1]: Starting systemd-journald.service - Journal Service...
Oct 19 14:32:17.136824 systemd[1]: Starting systemd-modules-load.service - Load Kernel Modules...
Oct 19 14:32:17.136833 systemd[1]: Starting systemd-network-generator.service - Generate Network Units from Kernel Command Line...
Oct 19 14:32:17.136843 systemd[1]: Starting systemd-vconsole-setup.service - Virtual Console Setup...
Oct 19 14:32:17.136852 systemd[1]: Finished ignition-setup-pre.service - Ignition env setup.
Oct 19 14:32:17.136864 systemd[1]: Finished kmod-static-nodes.service - Create List of Static Device Nodes.
Oct 19 14:32:17.136881 systemd[1]: Finished systemd-network-generator.service - Generate Network Units from Kernel Command Line.
Oct 19 14:32:17.136908 systemd[1]: Reached target network-pre.target - Preparation for Network.
Oct 19 14:32:17.136915 systemd[1]: Listening on systemd-networkd-resolve-hook.socket - Network Management Resolve Hook Socket.
Oct 19 14:32:17.136922 systemd[1]: Starting systemd-tmpfiles-setup-dev-early.service - Create Static Device Nodes in /dev gracefully...
Oct 19 14:32:17.136928 kernel: bridge: filtering via arp/ip/ip6tables is no longer available by default. Update your scripts to load br_netfilter if you need this.
Oct 19 14:32:17.136937 kernel: Bridge firewalling registered
Oct 19 14:32:17.136943 systemd[1]: Finished systemd-modules-load.service - Load Kernel Modules.
Oct 19 14:32:17.136974 systemd-journald[1085]: Collecting audit messages is enabled.
Oct 19 14:32:17.137000 systemd[1]: Starting systemd-sysctl.service - Apply Kernel Variables...
Oct 19 14:32:17.137013 kernel: audit: type=1130 audit(1792420337.125:2): 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'
Oct 19 14:32:17.137024 systemd[1]: Finished systemd-tmpfiles-setup-dev-early.service - Create Static Device Nodes in /dev gracefully.
Oct 19 14:32:17.137035 systemd-journald[1085]: Journal started
Oct 19 14:32:17.137052 systemd-journald[1085]: Runtime Journal (/run/log/journal/403354d927c0443c9d95c01e8e53d165) is 8M, max 158.4M, 150.4M free.
Oct 19 14:32:17.125000 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'
Oct 19 14:32:17.005317 systemd-modules-load[1086]: Using 2 probe threads
Oct 19 14:32:17.138000 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'
Oct 19 14:32:17.118915 systemd-modules-load[1086]: Inserted module 'br_netfilter'
Oct 19 14:32:17.144000 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'
Oct 19 14:32:17.145711 kernel: audit: type=1130 audit(1792420337.138:3): 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'
Oct 19 14:32:17.146037 systemd[1]: Started systemd-journald.service - Journal Service.
Oct 19 14:32:17.146422 kernel: audit: type=1130 audit(1792420337.144:4): 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'
Oct 19 14:32:17.152857 systemd[1]: Starting systemd-tmpfiles-setup-dev.service - Create Static Device Nodes in /dev...
Oct 19 14:32:17.155717 systemd[1]: Starting systemd-tmpfiles-setup.service - Create System Files and Directories...
Oct 19 14:32:17.168168 systemd[1]: Finished systemd-tmpfiles-setup-dev.service - Create Static Device Nodes in /dev.
Oct 19 14:32:17.167000 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'
Oct 19 14:32:17.174106 kernel: audit: type=1130 audit(1792420337.167:5): 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'
Oct 19 14:32:17.175011 systemd-tmpfiles[1100]: /usr/lib/tmpfiles.d/systemd.conf:30: Duplicate line for path "/var/lib/systemd", ignoring.
Oct 19 14:32:17.175192 systemd-tmpfiles[1100]: /usr/lib/tmpfiles.d/var.conf:14: Duplicate line for path "/var/log", ignoring.
Oct 19 14:32:17.192801 systemd[1]: Finished systemd-tmpfiles-setup.service - Create System Files and Directories.
Oct 19 14:32:17.192000 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'
Oct 19 14:32:17.197900 systemd-vconsole-setup[1089]: Configuration of first virtual console was skipped, ignoring remaining ones.
Oct 19 14:32:17.201903 systemd[1]: Finished systemd-vconsole-setup.service - Virtual Console Setup.
Oct 19 14:32:17.205698 kernel: audit: type=1130 audit(1792420337.192:6): 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'
Oct 19 14:32:17.204000 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'
Oct 19 14:32:17.205946 systemd[1]: systemd-sysctl.service: Deactivated successfully.
Oct 19 14:32:17.206039 systemd[1]: Finished systemd-sysctl.service - Apply Kernel Variables.
Oct 19 14:32:17.211996 kernel: audit: type=1130 audit(1792420337.204: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'
Oct 19 14:32:17.213000 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'
Oct 19 14:32:17.213000 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'
Oct 19 14:32:17.220173 systemd[1]: Starting dracut-cmdline-ask.service - dracut ask for additional cmdline parameters...
Oct 19 14:32:17.222651 kernel: audit: type=1130 audit(1792420337.213: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'
Oct 19 14:32:17.222675 kernel: audit: type=1131 audit(1792420337.213: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'
Oct 19 14:32:17.225000 audit: BPF prog-id=5 op=LOAD
Oct 19 14:32:17.228102 kernel: audit: type=1334 audit(1792420337.225:10): prog-id=5 op=LOAD
Oct 19 14:32:17.233166 systemd[1]: Starting systemd-resolved.service - Network Name Resolution...
Oct 19 14:32:17.250154 systemd[1]: Finished dracut-cmdline-ask.service - dracut ask for additional cmdline parameters.
Oct 19 14:32:17.253000 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'
Oct 19 14:32:17.259254 kernel: audit: type=1130 audit(1792420337.253:11): 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'
Oct 19 14:32:17.260060 systemd[1]: Starting dracut-cmdline.service - dracut cmdline hook...
Oct 19 14:32:17.275124 systemd-resolved[1107]: Positive Trust Anchors:
Oct 19 14:32:17.275385 systemd-resolved[1107]: . IN DS 20326 8 2 e06d44b80b8f1d39a95c0b0d7c65d08458e880409bbc683457104237c7f8ec8d
Oct 19 14:32:17.275389 systemd-resolved[1107]: . IN DS 38696 8 2 683d2d0acb8c9b712a1948b27f741219298d0a450d612c483af444a4c0fb2b16
Oct 19 14:32:17.275424 systemd-resolved[1107]: 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
Oct 19 14:32:17.341002 dracut-cmdline[1118]: dracut-112
Oct 19 14:32:17.341002 dracut-cmdline[1118]: Using kernel command line parameters:  SYSTEMD_SULOGIN_FORCE=1   rootflags=rw mount.usrflags=ro BOOT_IMAGE=/flatcar/vmlinuz-a mount.usr=/dev/mapper/usr verity.usr=PARTUUID=7130c94a-213a-4e5a-8e26-6cce9662f132 rootflags=rw mount.usrflags=ro consoleblank=0 root=LABEL=ROOT console=tty1 console=ttyS0,115200n8 earlyprintk=ttyS0,115200 flatcar.first_boot=detected flatcar.oem.id=azure flatcar.autologin verity.usrhash=1965178a28db43350a0cd55c710101aee06f10df191fb062190e930135599d4e
Oct 19 14:32:17.435033 systemd-resolved[1107]: Defaulting to hostname 'linux'.
Oct 19 14:32:17.437498 systemd[1]: Started systemd-resolved.service - Network Name Resolution.
Oct 19 14:32:17.439000 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'
Oct 19 14:32:17.439707 systemd[1]: Reached target nss-lookup.target - Host and Network Name Lookups.
Oct 19 14:32:17.535099 kernel: Loading iSCSI transport class v2.0-870.
Oct 19 14:32:17.593104 kernel: iscsi: registered transport (tcp)
Oct 19 14:32:17.639104 kernel: iscsi: registered transport (qla4xxx)
Oct 19 14:32:17.639156 kernel: QLogic iSCSI HBA Driver
Oct 19 14:32:17.684958 systemd[1]: afterburn-network-kargs.service - Afterburn Initrd Setup Network Kernel Arguments skipped, no trigger condition checks were met.
Oct 19 14:32:17.699947 systemd[1]: Finished dracut-cmdline.service - dracut cmdline hook.
Oct 19 14:32:17.698000 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'
Oct 19 14:32:17.704010 systemd[1]: Starting dracut-pre-udev.service - dracut pre-udev hook...
Oct 19 14:32:17.733033 systemd[1]: Finished dracut-pre-udev.service - dracut pre-udev hook.
Oct 19 14:32:17.732000 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'
Oct 19 14:32:17.735000 audit: BPF prog-id=6 op=LOAD
Oct 19 14:32:17.735000 audit: BPF prog-id=7 op=LOAD
Oct 19 14:32:17.736966 systemd[1]: Starting systemd-udevd.service - Rule-based Manager for Device Events and Files...
Oct 19 14:32:17.832628 systemd-udevd[1252]: Using default interface naming scheme 'v261'.
Oct 19 14:32:17.879943 systemd[1]: Started systemd-udevd.service - Rule-based Manager for Device Events and Files.
Oct 19 14:32:17.883000 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'
Oct 19 14:32:17.888847 systemd[1]: Starting dracut-pre-trigger.service - dracut pre-trigger hook...
Oct 19 14:32:17.896304 systemd[1]: Starting systemd-networkd.service - Network Management...
Oct 19 14:32:17.894000 audit: BPF prog-id=8 op=LOAD
Oct 19 14:32:17.913908 dracut-pre-trigger[1273]: rd.md=0: removing MD RAID activation
Oct 19 14:32:17.942640 systemd[1]: Finished dracut-pre-trigger.service - dracut pre-trigger hook.
Oct 19 14:32:17.944536 systemd-networkd[1275]: Failed to open nftables netlink socket. IPMasquerade= and NFTSet= settings will not be applied. Ignoring: Protocol not supported
Oct 19 14:32:17.951000 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'
Oct 19 14:32:17.953689 systemd-networkd[1275]: lo: Link UP
Oct 19 14:32:17.953701 systemd-networkd[1275]: lo: Gained carrier
Oct 19 14:32:17.957000 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'
Oct 19 14:32:17.954883 systemd[1]: Starting systemd-udev-trigger.service - Coldplug All udev Devices...
Oct 19 14:32:17.957198 systemd[1]: Started systemd-networkd.service - Network Management.
Oct 19 14:32:17.959063 systemd[1]: Reached target network.target - Network.
Oct 19 14:32:18.014442 systemd[1]: Finished systemd-udev-trigger.service - Coldplug All udev Devices.
Oct 19 14:32:18.019000 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'
Oct 19 14:32:18.022157 systemd[1]: Starting dracut-initqueue.service - dracut initqueue hook...
Oct 19 14:32:18.143107 systemd[1]: systemd-vconsole-setup.service: Deactivated successfully.
Oct 19 14:32:18.144201 systemd[1]: Stopped systemd-vconsole-setup.service - Virtual Console Setup.
Oct 19 14:32:18.148000 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'
Oct 19 14:32:18.149206 systemd[1]: Stopping systemd-vconsole-setup.service - Virtual Console Setup...
Oct 19 14:32:18.152451 systemd[1]: Starting systemd-vconsole-setup.service - Virtual Console Setup...
Oct 19 14:32:18.208650 kernel: hv_storvsc f8b3781a-1e82-4818-a1c3-63d806ec15bb: tag#94 cmd 0x85 status: scsi 0x2 srb 0x6 host 0xc0000001
Oct 19 14:32:18.208870 kernel: hv_vmbus: registering driver hv_netvsc
Oct 19 14:32:18.210793 systemd-vconsole-setup[1347]: Configuration of first virtual console was skipped, ignoring remaining ones.
Oct 19 14:32:18.216611 systemd[1]: Finished systemd-vconsole-setup.service - Virtual Console Setup.
Oct 19 14:32:18.222098 kernel: hv_netvsc f8615163-0000-1000-2000-000d3ad9e1b2 (unnamed net_device) (uninitialized): VF slot 1 added
Oct 19 14:32:18.223000 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'
Oct 19 14:32:18.238529 systemd-networkd[1275]: eth0: Configuring with /usr/lib/systemd/network/zz-default.network.
Oct 19 14:32:18.239495 systemd-networkd[1275]: eth0: Link UP
Oct 19 14:32:18.239591 systemd-networkd[1275]: eth0: Gained carrier
Oct 19 14:32:18.259419 systemd-networkd[1275]: eth0: DHCPv4 address 10.0.0.23/24, gateway 10.0.0.1 acquired from 168.63.129.16
Oct 19 14:32:18.367102 kernel: nvme nvme0: using unchecked data buffer
Oct 19 14:32:18.978995 systemd[1]: Found device dev-disk-by\x2dlabel-EFI\x2dSYSTEM.device - MSFT NVMe Accelerator v1.0 EFI-SYSTEM.
Oct 19 14:32:19.230254 systemd[1]: Found device dev-disk-by\x2dlabel-OEM.device - MSFT NVMe Accelerator v1.0 OEM.
Oct 19 14:32:19.241116 kernel: hv_pci 00000001-7870-47b5-b203-907d12ca697e: PCI VMBus probing: Using version 0x10004
Oct 19 14:32:19.245700 kernel: hv_pci 00000001-7870-47b5-b203-907d12ca697e: PCI host bridge to bus 7870:00
Oct 19 14:32:19.245902 kernel: pci_bus 7870:00: root bus resource [mem 0xfc2000000-0xfc4007fff window]
Oct 19 14:32:19.248242 kernel: pci_bus 7870:00: No busn resource found for root bus, will use [bus 00-ff]
Oct 19 14:32:19.254152 systemd[1]: Found device dev-disk-by\x2dpartlabel-USR\x2dA.device - MSFT NVMe Accelerator v1.0 USR-A.
Oct 19 14:32:19.259235 kernel: pci 7870:00:00.0: [1414:00ba] type 00 class 0x020000 PCIe Endpoint
Oct 19 14:32:19.264853 systemd[1]: Finished dracut-initqueue.service - dracut initqueue hook.
Oct 19 14:32:19.277974 kernel: pci 7870:00:00.0: BAR 0 [mem 0xfc2000000-0xfc3ffffff 64bit pref]
Oct 19 14:32:19.278051 kernel: pci 7870:00:00.0: BAR 4 [mem 0xfc4000000-0xfc4007fff 64bit pref]
Oct 19 14:32:19.278113 kernel: pci 7870:00:00.0: enabling Extended Tags
Oct 19 14:32:19.270000 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'
Oct 19 14:32:19.281372 systemd[1]: Found device dev-disk-by\x2dlabel-ROOT.device - MSFT NVMe Accelerator v1.0 ROOT.
Oct 19 14:32:19.294023 kernel: pci_bus 7870:00: busn_res: [bus 00-ff] end is updated to 00
Oct 19 14:32:19.293997 systemd[1]: Reached target remote-fs-pre.target - Preparation for Remote File Systems.
Oct 19 14:32:19.298405 kernel: pci 7870:00:00.0: BAR 0 [mem 0xfc2000000-0xfc3ffffff 64bit pref]: assigned
Oct 19 14:32:19.296415 systemd[1]: Reached target remote-cryptsetup.target - Remote Encrypted Volumes.
Oct 19 14:32:19.303557 kernel: pci 7870:00:00.0: BAR 4 [mem 0xfc4000000-0xfc4007fff 64bit pref]: assigned
Oct 19 14:32:19.304333 systemd[1]: Reached target remote-fs.target - Remote File Systems.
Oct 19 14:32:19.315162 systemd[1]: Mounting oem.mount - /oem...
Oct 19 14:32:19.321205 kernel: mana 7870:00:00.0: enabling device (0000 -> 0002)
Oct 19 14:32:19.321740 systemd[1]: Starting disk-uuid.service - Generate new UUID for disk GPT if necessary...
Oct 19 14:32:19.336098 kernel: mana 7870:00:00.0: Microsoft Azure Network Adapter protocol version: 0.1.1
Oct 19 14:32:19.339425 kernel: hv_netvsc f8615163-0000-1000-2000-000d3ad9e1b2 eth0: VF registering: eth1
Oct 19 14:32:19.339703 kernel: mana 7870:00:00.0 eth1: joined to eth0
Oct 19 14:32:19.344101 kernel: mana 7870:00:00.0 enP30832s1: renamed from eth1
Oct 19 14:32:19.344326 systemd-networkd[1275]: eth1: Interface name change detected, renamed to enP30832s1.
Oct 19 14:32:19.353106 kernel: BTRFS: device label OEM devid 1 transid 11 /dev/nvme0n1p6 (259:5) scanned by mount (1395)
Oct 19 14:32:19.358169 kernel: BTRFS info (device nvme0n1p6): first mount of filesystem 2e83616a-6355-4c0c-b113-80fc4479c402
Oct 19 14:32:19.358202 kernel: BTRFS info (device nvme0n1p6): using crc32c (crc32c-lib) checksum algorithm
Oct 19 14:32:19.423131 kernel: BTRFS info (device nvme0n1p6): enabling ssd optimizations
Oct 19 14:32:19.423174 kernel: BTRFS info (device nvme0n1p6): turning on async discard
Oct 19 14:32:19.424384 kernel: BTRFS info (device nvme0n1p6): enabling free space tree
Oct 19 14:32:19.425806 systemd[1]: Mounted oem.mount - /oem.
Oct 19 14:32:19.430674 systemd[1]: Starting ignition-fetch-offline.service - Ignition (fetch-offline)...
Oct 19 14:32:19.448107 kernel: mana 7870:00:00.0 enP30832s1: Configured vPort 0 PD 18 DB 16
Oct 19 14:32:19.454158 kernel: mana 7870:00:00.0 enP30832s1: Configured steering vPort 0 entries 64
Oct 19 14:32:19.454405 kernel: hv_netvsc f8615163-0000-1000-2000-000d3ad9e1b2 eth0: Data path switched to VF: enP30832s1
Oct 19 14:32:19.454701 systemd-networkd[1275]: enP30832s1: Link UP
Oct 19 14:32:19.454710 systemd-networkd[1275]: enP30832s1: Gained carrier
Oct 19 14:32:19.981212 systemd-networkd[1275]: eth0: Gained IPv6LL
Oct 19 14:32:20.783570 disk-uuid[1402]: Warning: The kernel is still using the old partition table.
Oct 19 14:32:20.783570 disk-uuid[1402]: The new table will be used at the next reboot or after you
Oct 19 14:32:20.783570 disk-uuid[1402]: run partprobe(8) or kpartx(8)
Oct 19 14:32:20.783570 disk-uuid[1402]: The operation has completed successfully.
Oct 19 14:32:21.145851 systemd[1]: disk-uuid.service: Deactivated successfully.
Oct 19 14:32:21.145970 systemd[1]: Finished disk-uuid.service - Generate new UUID for disk GPT if necessary.
Oct 19 14:32:21.149000 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'
Oct 19 14:32:21.149000 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'
Oct 19 14:32:21.158719 systemd[1]: Mounting boot.mount - Boot partition...
Oct 19 14:32:21.242660 systemd[1]: Mounted boot.mount - Boot partition.
Oct 19 14:32:22.001626 ignition[1420]: Ignition 2.27.0
Oct 19 14:32:22.001639 ignition[1420]: Stage: fetch-offline
Oct 19 14:32:22.006000 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'
Oct 19 14:32:22.004290 systemd[1]: Finished ignition-fetch-offline.service - Ignition (fetch-offline).
Oct 19 14:32:22.001950 ignition[1420]: no config dir at "/run/ignition/base.d"
Oct 19 14:32:22.008354 systemd[1]: Starting ignition-fetch.service - Ignition (fetch)...
Oct 19 14:32:22.001961 ignition[1420]: no config dir at "/etc/ignition/base.d"
Oct 19 14:32:22.002074 ignition[1420]: no config dir at "/usr/lib/ignition/base.d"
Oct 19 14:32:22.002095 ignition[1420]: no configs found in "base.d" across system config directories
Oct 19 14:32:22.002103 ignition[1420]: no config dir at "/run/ignition/base.platform.d/azure"
Oct 19 14:32:22.002107 ignition[1420]: no config dir at "/etc/ignition/base.platform.d/azure"
Oct 19 14:32:22.002114 ignition[1420]: no config dir at "/usr/lib/ignition/base.platform.d/azure"
Oct 19 14:32:22.002117 ignition[1420]: no configs found in "base.platform.d/azure" across system config directories
Oct 19 14:32:22.002300 ignition[1420]: reading system config file "/run/ignition/user.ign"
Oct 19 14:32:22.002306 ignition[1420]: no config at "/run/ignition/user.ign"
Oct 19 14:32:22.002310 ignition[1420]: reading system config file "/etc/ignition/user.ign"
Oct 19 14:32:22.002314 ignition[1420]: no config at "/etc/ignition/user.ign"
Oct 19 14:32:22.002318 ignition[1420]: reading system config file "/usr/lib/ignition/user.ign"
Oct 19 14:32:22.002343 ignition[1420]: no config at "/usr/lib/ignition/user.ign"
Oct 19 14:32:22.002348 ignition[1420]: failed to fetch config: resource requires networking
Oct 19 14:32:22.002542 ignition[1420]: Ignition finished successfully
Oct 19 14:32:22.024611 ignition[1455]: Ignition 2.27.0
Oct 19 14:32:22.024618 ignition[1455]: Stage: fetch
Oct 19 14:32:22.024876 ignition[1455]: no config dir at "/run/ignition/base.d"
Oct 19 14:32:22.024881 ignition[1455]: no config dir at "/etc/ignition/base.d"
Oct 19 14:32:22.024892 ignition[1455]: no config dir at "/usr/lib/ignition/base.d"
Oct 19 14:32:22.024895 ignition[1455]: no configs found in "base.d" across system config directories
Oct 19 14:32:22.024901 ignition[1455]: no config dir at "/run/ignition/base.platform.d/azure"
Oct 19 14:32:22.024906 ignition[1455]: no config dir at "/etc/ignition/base.platform.d/azure"
Oct 19 14:32:22.024910 ignition[1455]: no config dir at "/usr/lib/ignition/base.platform.d/azure"
Oct 19 14:32:22.024913 ignition[1455]: no configs found in "base.platform.d/azure" across system config directories
Oct 19 14:32:22.025023 ignition[1455]: reading system config file "/run/ignition/user.ign"
Oct 19 14:32:22.025028 ignition[1455]: no config at "/run/ignition/user.ign"
Oct 19 14:32:22.025031 ignition[1455]: reading system config file "/etc/ignition/user.ign"
Oct 19 14:32:22.025035 ignition[1455]: no config at "/etc/ignition/user.ign"
Oct 19 14:32:22.025039 ignition[1455]: reading system config file "/usr/lib/ignition/user.ign"
Oct 19 14:32:22.025049 ignition[1455]: no config at "/usr/lib/ignition/user.ign"
Oct 19 14:32:22.025069 ignition[1455]: GET http://169.254.169.254/metadata/instance/compute/userData?api-version=2021-01-01&format=text: attempt #1
Oct 19 14:32:22.097789 ignition[1455]: GET result: OK
Oct 19 14:32:22.097841 ignition[1455]: config has been read from IMDS userdata
Oct 19 14:32:22.097856 ignition[1455]: parsing config with SHA512: a13c8e33a6389b9977e6d604b9295e082b9f3cf7c379ea68d41a85c38feb919c47cc503d186d0618c0bbfc8e33d5665d67c84d19de2b6f58133bbfc9306ba89c
Oct 19 14:32:22.100313 unknown[1455]: fetched base config from "system"
Oct 19 14:32:22.100487 ignition[1455]: fetch: fetch complete
Oct 19 14:32:22.104000 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'
Oct 19 14:32:22.100319 unknown[1455]: fetched base config from "system"
Oct 19 14:32:22.100492 ignition[1455]: fetch: fetch passed
Oct 19 14:32:22.100325 unknown[1455]: fetched user config from "azure"
Oct 19 14:32:22.100527 ignition[1455]: Ignition finished successfully
Oct 19 14:32:22.101863 systemd[1]: Finished ignition-fetch.service - Ignition (fetch).
Oct 19 14:32:22.108177 systemd[1]: Starting ignition-kargs.service - Ignition (kargs)...
Oct 19 14:32:22.122311 ignition[1461]: Ignition 2.27.0
Oct 19 14:32:22.122324 ignition[1461]: Stage: kargs
Oct 19 14:32:22.126000 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'
Oct 19 14:32:22.124593 systemd[1]: Finished ignition-kargs.service - Ignition (kargs).
Oct 19 14:32:22.122557 ignition[1461]: no config dir at "/run/ignition/base.d"
Oct 19 14:32:22.136726 kernel: kauditd_printk_skb: 17 callbacks suppressed
Oct 19 14:32:22.132554 systemd[1]: Starting ignition-disks.service - Ignition (disks)...
Oct 19 14:32:22.122562 ignition[1461]: no config dir at "/etc/ignition/base.d"
Oct 19 14:32:22.139209 kernel: audit: type=1130 audit(1792420342.126:29): 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'
Oct 19 14:32:22.122571 ignition[1461]: no config dir at "/usr/lib/ignition/base.d"
Oct 19 14:32:22.122574 ignition[1461]: no configs found in "base.d" across system config directories
Oct 19 14:32:22.122580 ignition[1461]: no config dir at "/run/ignition/base.platform.d/azure"
Oct 19 14:32:22.122585 ignition[1461]: no config dir at "/etc/ignition/base.platform.d/azure"
Oct 19 14:32:22.122589 ignition[1461]: no config dir at "/usr/lib/ignition/base.platform.d/azure"
Oct 19 14:32:22.122592 ignition[1461]: no configs found in "base.platform.d/azure" across system config directories
Oct 19 14:32:22.123214 ignition[1461]: kargs: kargs passed
Oct 19 14:32:22.123250 ignition[1461]: Ignition finished successfully
Oct 19 14:32:22.166349 systemd[1]: ignition-kargs.service: Deactivated successfully.
Oct 19 14:32:22.168000 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'
Oct 19 14:32:22.171000 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'
Oct 19 14:32:22.179619 kernel: audit: type=1131 audit(1792420342.168:30): 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'
Oct 19 14:32:22.166451 systemd[1]: Stopped ignition-kargs.service - Ignition (kargs).
Oct 19 14:32:22.171000 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'
Oct 19 14:32:22.182827 kernel: audit: type=1131 audit(1792420342.171:31): 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'
Oct 19 14:32:22.172207 systemd[1]: ignition-fetch.service: Deactivated successfully.
Oct 19 14:32:22.185133 kernel: audit: type=1131 audit(1792420342.171:32): 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'
Oct 19 14:32:22.172311 systemd[1]: Stopped ignition-fetch.service - Ignition (fetch).
Oct 19 14:32:22.172731 systemd[1]: ignition-fetch-offline.service: Deactivated successfully.
Oct 19 14:32:22.172812 systemd[1]: Stopped ignition-fetch-offline.service - Ignition (fetch-offline).
Oct 19 14:32:22.173433 systemd[1]: Unmounting oem.mount - /oem...
Oct 19 14:32:22.194299 systemd[1]: oem.mount: Deactivated successfully.
Oct 19 14:32:22.195947 kernel: BTRFS info (device nvme0n1p6): last unmount of filesystem 2e83616a-6355-4c0c-b113-80fc4479c402
Oct 19 14:32:22.194420 systemd[1]: Unmounted oem.mount - /oem.
Oct 19 14:32:22.218540 ignition[1471]: Ignition 2.27.0
Oct 19 14:32:22.218552 ignition[1471]: Stage: disks
Oct 19 14:32:22.219000 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'
Oct 19 14:32:22.218815 ignition[1471]: no config dir at "/run/ignition/base.d"
Oct 19 14:32:22.220751 systemd[1]: Finished ignition-disks.service - Ignition (disks).
Oct 19 14:32:22.235132 kernel: audit: type=1130 audit(1792420342.219:33): 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'
Oct 19 14:32:22.218821 ignition[1471]: no config dir at "/etc/ignition/base.d"
Oct 19 14:32:22.221032 systemd[1]: Reached target initrd-root-device.target - Initrd Root Device.
Oct 19 14:32:22.218834 ignition[1471]: no config dir at "/usr/lib/ignition/base.d"
Oct 19 14:32:22.221215 systemd[1]: Reached target local-fs-pre.target - Preparation for Local File Systems.
Oct 19 14:32:22.218837 ignition[1471]: no configs found in "base.d" across system config directories
Oct 19 14:32:22.221244 systemd[1]: Reached target local-fs.target - Local File Systems.
Oct 19 14:32:22.218844 ignition[1471]: no config dir at "/run/ignition/base.platform.d/azure"
Oct 19 14:32:22.221443 systemd[1]: Reached target sysinit.target - System Initialization.
Oct 19 14:32:22.218848 ignition[1471]: no config dir at "/etc/ignition/base.platform.d/azure"
Oct 19 14:32:22.232798 systemd[1]: Reached target basic.target - Basic System.
Oct 19 14:32:22.218852 ignition[1471]: no config dir at "/usr/lib/ignition/base.platform.d/azure"
Oct 19 14:32:22.218855 ignition[1471]: no configs found in "base.platform.d/azure" across system config directories
Oct 19 14:32:22.219465 ignition[1471]: disks: disks passed
Oct 19 14:32:22.219501 ignition[1471]: Ignition finished successfully
Oct 19 14:32:22.253234 systemd[1]: Starting dracut-pre-mount.service - dracut pre-mount hook...
Oct 19 14:32:22.271927 systemd[1]: Finished dracut-pre-mount.service - dracut pre-mount hook.
Oct 19 14:32:22.270000 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'
Oct 19 14:32:22.280159 kernel: audit: type=1130 audit(1792420342.270:34): 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'
Oct 19 14:32:22.277180 systemd[1]: Starting systemd-fsck-root.service - File System Check on /dev/disk/by-label/ROOT...
Oct 19 14:32:22.462181 systemd-fsck[1489]: ROOT: clean, 15/6361680 files, 408771/6359552 blocks
Oct 19 14:32:22.466312 systemd[1]: Finished systemd-fsck-root.service - File System Check on /dev/disk/by-label/ROOT.
Oct 19 14:32:22.468000 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'
Oct 19 14:32:22.473777 systemd[1]: Mounting sysroot.mount - /sysroot...
Oct 19 14:32:22.475592 kernel: audit: type=1130 audit(1792420342.468:35): 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'
Oct 19 14:32:22.674125 kernel: EXT4-fs (nvme0n1p9): Supports (experimental) DIO atomic writes awu_min: 4096, awu_max: 4096
Oct 19 14:32:22.825097 kernel: EXT4-fs (nvme0n1p9): mounted filesystem 6b5977bf-aab4-4092-9e41-941731a7ece1 r/w with ordered data mode. Quota mode: none.
Oct 19 14:32:22.825802 systemd[1]: Mounted sysroot.mount - /sysroot.
Oct 19 14:32:22.828348 systemd[1]: Reached target initrd-root-fs.target - Initrd Root File System.
Oct 19 14:32:22.845517 systemd[1]: Mounting sysroot-usr.mount - /sysroot/usr...
Oct 19 14:32:22.852172 systemd[1]: Starting flatcar-metadata-hostname.service - Flatcar Metadata Hostname Agent...
Oct 19 14:32:22.852295 systemd[1]: ignition-remount-sysroot.service - Remount /sysroot read-write for Ignition skipped, unmet condition check ConditionPathIsReadWrite=!/sysroot
Oct 19 14:32:22.852329 systemd[1]: Reached target ignition-diskful.target - Ignition Boot Disk Setup.
Oct 19 14:32:22.863290 systemd[1]: Mounted sysroot-usr.mount - /sysroot/usr.
Oct 19 14:32:22.872164 systemd[1]: Starting initrd-setup-root.service - Root filesystem setup...
Oct 19 14:32:24.750103 kernel: loop1: detected capacity change from 0 to 44505
Oct 19 14:32:24.799105 kernel:  loop1: p1 p2 p3
Oct 19 14:32:24.909800 kernel: device-mapper: verity: sha256 using "sha256-lib"
Oct 19 14:32:24.909853 kernel: device-mapper: verity: Unrecognized verity feature request: root_hash_sig_key_desc
Oct 19 14:32:24.911402 kernel: device-mapper: table: 254:1: verity: Unrecognized verity feature request (-EINVAL)
Oct 19 14:32:24.912572 kernel: device-mapper: ioctl: error adding target to table
Oct 19 14:32:24.913007 systemd-confext[1576]: device-mapper: reload ioctl on loop1p1-14-verity (254:1) failed: Invalid argument
Oct 19 14:32:24.949098 kernel: device-mapper: verity: sha256 using "sha256-lib"
Oct 19 14:32:25.192127 kernel: erofs (device dm-1): mounted with root inode @ nid 40.
Oct 19 14:32:25.209101 kernel: loop2: detected capacity change from 0 to 44505
Oct 19 14:32:25.218178 kernel:  loop2: p1 p2 p3
Oct 19 14:32:25.223205 kernel: device-mapper: verity: sha256 using "sha256-lib"
Oct 19 14:32:25.223251 kernel: device-mapper: verity: Unrecognized verity feature request: root_hash_sig_key_desc
Oct 19 14:32:25.224620 kernel: device-mapper: table: 254:1: verity: Unrecognized verity feature request (-EINVAL)
Oct 19 14:32:25.225699 kernel: device-mapper: ioctl: error adding target to table
Oct 19 14:32:25.225765 (sd-merge)[1587]: device-mapper: reload ioctl on loop2p1-18-verity (254:1) failed: Invalid argument
Oct 19 14:32:25.230265 kernel: device-mapper: verity: sha256 using "sha256-lib"
Oct 19 14:32:25.248019 (sd-merge)[1587]: Using extensions '00-flatcar-default.raw'.
Oct 19 14:32:25.250470 kernel: erofs (device dm-1): mounted with root inode @ nid 40.
Oct 19 14:32:25.248877 (sd-merge)[1587]: Merged extensions into '/sysroot/etc'.
Oct 19 14:32:25.255070 initrd-setup-root[1594]: /etc      00-flatcar-default Mon 2026-10-19 14:32:17 UTC
Oct 19 14:32:25.255515 systemd[1]: Finished initrd-setup-root.service - Root filesystem setup.
Oct 19 14:32:25.258000 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'
Oct 19 14:32:25.263110 kernel: audit: type=1130 audit(1792420345.258:36): 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'
Oct 19 14:32:25.263255 systemd[1]: Starting ignition-mount.service - Ignition (mount)...
Oct 19 14:32:25.299075 ignition[1599]: INFO     : Ignition 2.27.0
Oct 19 14:32:25.299075 ignition[1599]: INFO     : Stage: mount
Oct 19 14:32:25.301835 ignition[1599]: INFO     : no config dir at "/run/ignition/base.d"
Oct 19 14:32:25.301835 ignition[1599]: INFO     : no config dir at "/etc/ignition/base.d"
Oct 19 14:32:25.301835 ignition[1599]: INFO     : no config dir at "/usr/lib/ignition/base.d"
Oct 19 14:32:25.301835 ignition[1599]: INFO     : no configs found in "base.d" across system config directories
Oct 19 14:32:25.301835 ignition[1599]: INFO     : no config dir at "/run/ignition/base.platform.d/azure"
Oct 19 14:32:25.301835 ignition[1599]: INFO     : no config dir at "/etc/ignition/base.platform.d/azure"
Oct 19 14:32:25.301835 ignition[1599]: INFO     : no config dir at "/usr/lib/ignition/base.platform.d/azure"
Oct 19 14:32:25.301835 ignition[1599]: INFO     : no configs found in "base.platform.d/azure" across system config directories
Oct 19 14:32:25.301835 ignition[1599]: INFO     : mount: mount passed
Oct 19 14:32:25.301835 ignition[1599]: INFO     : Ignition finished successfully
Oct 19 14:32:25.301000 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'
Oct 19 14:32:25.322142 kernel: audit: type=1130 audit(1792420345.301:37): 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'
Oct 19 14:32:25.302274 systemd[1]: Finished ignition-mount.service - Ignition (mount).
Oct 19 14:32:52.620758 coreos-metadata[1499]: Oct 19 14:32:52.620 WARN Failed to get fabric address from DHCP: maximum number of retries (60) reached
Oct 19 14:32:52.620758 coreos-metadata[1499]: Oct 19 14:32:52.620 INFO using fallback address
Oct 19 14:32:52.632923 coreos-metadata[1499]: Oct 19 14:32:52.632 INFO Fetching http://168.63.129.16/?comp=versions: Attempt #1
Oct 19 14:32:52.635464 coreos-metadata[1499]: Oct 19 14:32:52.635 INFO Fetch successful
Oct 19 14:32:52.635464 coreos-metadata[1499]: Oct 19 14:32:52.635 INFO Fetching http://169.254.169.254/metadata/instance/compute/name?api-version=2017-08-01&format=text: Attempt #1
Oct 19 14:32:52.641945 coreos-metadata[1499]: Oct 19 14:32:52.641 INFO Fetch successful
Oct 19 14:32:52.641945 coreos-metadata[1499]: Oct 19 14:32:52.641 INFO wrote hostname ci-9999.9.9-e-dd7c10426c to /sysroot/etc/hostname
Oct 19 14:32:52.646375 systemd[1]: Finished flatcar-metadata-hostname.service - Flatcar Metadata Hostname Agent.
Oct 19 14:32:52.648000 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'
Oct 19 14:32:52.653923 systemd[1]: Starting ignition-files.service - Ignition (files)...
Oct 19 14:32:52.658353 kernel: audit: type=1130 audit(1792420372.648:38): 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'
Oct 19 14:32:52.667173 systemd[1]: Mounting oem.mount - /oem...
Oct 19 14:32:52.686222 kernel: BTRFS: device label OEM devid 1 transid 11 /dev/nvme0n1p6 (259:5) scanned by mount (1664)
Oct 19 14:32:52.686259 kernel: BTRFS info (device nvme0n1p6): first mount of filesystem 2e83616a-6355-4c0c-b113-80fc4479c402
Oct 19 14:32:52.687441 kernel: BTRFS info (device nvme0n1p6): using crc32c (crc32c-lib) checksum algorithm
Oct 19 14:32:52.693162 kernel: BTRFS info (device nvme0n1p6): enabling ssd optimizations
Oct 19 14:32:52.693202 kernel: BTRFS info (device nvme0n1p6): turning on async discard
Oct 19 14:32:52.694447 kernel: BTRFS info (device nvme0n1p6): enabling free space tree
Oct 19 14:32:52.696167 systemd[1]: Mounted oem.mount - /oem.
Oct 19 14:32:52.699454 systemd[1]: Mounting sysroot-oem.mount - /sysroot/oem...
Oct 19 14:32:52.712817 systemd[1]: Mounted sysroot-oem.mount - /sysroot/oem.
Oct 19 14:32:52.728429 ignition[1683]: INFO     : Ignition 2.27.0
Oct 19 14:32:52.728429 ignition[1683]: INFO     : Stage: files
Oct 19 14:32:52.733137 ignition[1683]: INFO     : no config dir at "/run/ignition/base.d"
Oct 19 14:32:52.733137 ignition[1683]: INFO     : no config dir at "/etc/ignition/base.d"
Oct 19 14:32:52.733137 ignition[1683]: INFO     : no config dir at "/usr/lib/ignition/base.d"
Oct 19 14:32:52.733137 ignition[1683]: INFO     : no configs found in "base.d" across system config directories
Oct 19 14:32:52.733137 ignition[1683]: INFO     : no config dir at "/run/ignition/base.platform.d/azure"
Oct 19 14:32:52.733137 ignition[1683]: INFO     : no config dir at "/etc/ignition/base.platform.d/azure"
Oct 19 14:32:52.733137 ignition[1683]: INFO     : no config dir at "/usr/lib/ignition/base.platform.d/azure"
Oct 19 14:32:52.733137 ignition[1683]: INFO     : no configs found in "base.platform.d/azure" across system config directories
Oct 19 14:32:52.733137 ignition[1683]: DEBUG    : files: compiled without relabeling support, skipping
Oct 19 14:32:52.750227 ignition[1683]: INFO     : files: ensureUsers: op(1): [started]  creating or modifying user "core"
Oct 19 14:32:52.750227 ignition[1683]: DEBUG    : files: ensureUsers: op(1): executing: "usermod" "--root" "/sysroot" "core"
Oct 19 14:32:52.755435 ignition[1683]: INFO     : files: ensureUsers: op(1): [finished] creating or modifying user "core"
Oct 19 14:32:52.755435 ignition[1683]: INFO     : files: ensureUsers: op(2): [started]  adding ssh keys to user "core"
Oct 19 14:32:52.755435 ignition[1683]: INFO     : files: ensureUsers: op(2): [finished] adding ssh keys to user "core"
Oct 19 14:32:52.755435 ignition[1683]: INFO     : files: createFilesystemsFiles: createFiles: op(3): [started]  writing file "/sysroot/etc/extensions/ig.raw"
Oct 19 14:32:52.755435 ignition[1683]: INFO     : files: createFilesystemsFiles: createFiles: op(3): GET https://extensions.flatcar.org/extensions/ig-v0.50.0-x86-64.raw: attempt #1
Oct 19 14:32:52.754190 unknown[1683]: wrote ssh authorized keys file for user: core
Oct 19 14:32:53.341293 ignition[1683]: INFO     : files: createFilesystemsFiles: createFiles: op(3): GET result: OK
Oct 19 14:32:55.325353 ignition[1683]: INFO     : files: createFilesystemsFiles: createFiles: op(3): [finished] writing file "/sysroot/etc/extensions/ig.raw"
Oct 19 14:32:55.330186 ignition[1683]: INFO     : files: createFilesystemsFiles: createFiles: op(4): [started]  writing file "/sysroot/etc/flatcar/update.conf"
Oct 19 14:32:55.389235 ignition[1683]: INFO     : files: createFilesystemsFiles: createFiles: op(4): [finished] writing file "/sysroot/etc/flatcar/update.conf"
Oct 19 14:32:55.391548 ignition[1683]: INFO     : files: createResultFile: createFiles: op(5): [started]  writing file "/sysroot/etc/.ignition-result.json"
Oct 19 14:32:55.391548 ignition[1683]: INFO     : files: createResultFile: createFiles: op(5): [finished] writing file "/sysroot/etc/.ignition-result.json"
Oct 19 14:32:55.391548 ignition[1683]: INFO     : files: files passed
Oct 19 14:32:55.391548 ignition[1683]: INFO     : Ignition finished successfully
Oct 19 14:32:55.394919 systemd[1]: Finished ignition-files.service - Ignition (files).
Oct 19 14:32:55.402000 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'
Oct 19 14:32:55.406186 systemd[1]: Starting ignition-quench.service - Ignition (record completion)...
Oct 19 14:32:55.408867 kernel: audit: type=1130 audit(1792420375.402:39): 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'
Oct 19 14:32:55.421184 systemd[1]: Starting initrd-setup-root-after-ignition.service - Root filesystem completion...
Oct 19 14:32:55.463679 initrd-setup-root-after-ignition[1715]: grep: /sysroot/etc/flatcar/enabled-sysext.conf: No such file or directory
Oct 19 14:32:55.463679 initrd-setup-root-after-ignition[1715]: grep: /sysroot/usr/share/flatcar/enabled-sysext.conf: No such file or directory
Oct 19 14:32:55.468731 initrd-setup-root-after-ignition[1719]: grep: /sysroot/etc/flatcar/enabled-sysext.conf: No such file or directory
Oct 19 14:32:55.476103 kernel: loop3: detected capacity change from 0 to 44505
Oct 19 14:32:55.507098 kernel:  loop3: p1 p2 p3
Oct 19 14:32:55.507706 systemd[1]: ignition-quench.service: Deactivated successfully.
Oct 19 14:32:55.510000 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'
Oct 19 14:32:55.510000 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'
Oct 19 14:32:55.517266 kernel: audit: type=1130 audit(1792420375.510:40): 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'
Oct 19 14:32:55.507839 systemd[1]: Finished ignition-quench.service - Ignition (record completion).
Oct 19 14:32:55.520529 kernel: audit: type=1131 audit(1792420375.510:41): 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'
Oct 19 14:32:55.526114 kernel: device-mapper: verity: sha256 using "sha256-lib"
Oct 19 14:32:55.526148 kernel: device-mapper: verity: Unrecognized verity feature request: root_hash_sig_key_desc
Oct 19 14:32:55.533118 kernel: device-mapper: table: 254:2: verity: Unrecognized verity feature request (-EINVAL)
Oct 19 14:32:55.535655 systemd-confext[1721]: device-mapper: reload ioctl on loop3p1-21-verity (254:2) failed: Invalid argument
Oct 19 14:32:55.538562 kernel: device-mapper: ioctl: error adding target to table
Oct 19 14:32:55.542103 kernel: device-mapper: verity: sha256 using "sha256-lib"
Oct 19 14:32:55.561099 kernel: erofs (device dm-2): mounted with root inode @ nid 40.
Oct 19 14:32:55.585116 kernel: loop4: detected capacity change from 0 to 44505
Oct 19 14:32:55.593383 kernel:  loop4: p1 p2 p3
Oct 19 14:32:55.597987 kernel: device-mapper: verity: sha256 using "sha256-lib"
Oct 19 14:32:55.598022 kernel: device-mapper: verity: Unrecognized verity feature request: root_hash_sig_key_desc
Oct 19 14:32:55.600152 kernel: device-mapper: table: 254:2: verity: Unrecognized verity feature request (-EINVAL)
Oct 19 14:32:55.601824 kernel: device-mapper: ioctl: error adding target to table
Oct 19 14:32:55.601898 (sd-merge)[1734]: device-mapper: reload ioctl on loop4p1-25-verity (254:2) failed: Invalid argument
Oct 19 14:32:55.607159 kernel: device-mapper: verity: sha256 using "sha256-lib"
Oct 19 14:32:55.621858 (sd-merge)[1734]: Skipping extension refresh because no change was found, use --always-refresh=yes to always do a refresh.
Oct 19 14:32:55.626172 kernel: erofs (device dm-2): mounted with root inode @ nid 40.
Oct 19 14:32:58.791488 kernel: loop4: detected capacity change from 0 to 156464
Oct 19 14:32:58.879107 kernel: loop5: detected capacity change from 0 to 431832
Oct 19 14:32:58.953119 kernel:  loop5: p1 p2 p3
Oct 19 14:32:59.040051 kernel: device-mapper: verity: sha256 using "sha256-lib"
Oct 19 14:32:59.040119 kernel: device-mapper: verity: Unrecognized verity feature request: root_hash_sig_key_desc
Oct 19 14:32:59.041535 kernel: device-mapper: table: 254:2: verity: Unrecognized verity feature request (-EINVAL)
Oct 19 14:32:59.042659 kernel: device-mapper: ioctl: error adding target to table
Oct 19 14:32:59.043060 systemd-sysext[1742]: device-mapper: reload ioctl on loop5p1-31-verity (254:2) failed: Invalid argument
Oct 19 14:32:59.047499 kernel: device-mapper: verity: sha256 using "sha256-lib"
Oct 19 14:32:59.661103 kernel: erofs (device dm-2): mounted with root inode @ nid 39.
Oct 19 14:32:59.792114 kernel: loop6: detected capacity change from 0 to 135824
Oct 19 14:32:59.857296 kernel:  loop6: p1 p2 p3
Oct 19 14:32:59.911854 kernel: device-mapper: verity: sha256 using "sha256-lib"
Oct 19 14:32:59.911899 kernel: device-mapper: verity: Unrecognized verity feature request: root_hash_sig_key_desc
Oct 19 14:32:59.914015 kernel: device-mapper: table: 254:2: verity: Unrecognized verity feature request (-EINVAL)
Oct 19 14:32:59.915252 kernel: device-mapper: ioctl: error adding target to table
Oct 19 14:32:59.915658 systemd-sysext[1742]: device-mapper: reload ioctl on loop6p1-35-verity (254:2) failed: Invalid argument
Oct 19 14:32:59.919647 kernel: device-mapper: verity: sha256 using "sha256-lib"
Oct 19 14:33:00.157103 kernel: erofs (device dm-2): mounted with root inode @ nid 39.
Oct 19 14:33:00.197117 kernel: loop7: detected capacity change from 0 to 169080
Oct 19 14:33:00.495313 kernel:  loop7: p1 p2 p3
Oct 19 14:33:00.578646 kernel: device-mapper: verity: sha256 using "sha256-lib"
Oct 19 14:33:00.578701 kernel: device-mapper: verity: Unrecognized verity feature request: root_hash_sig_key_desc
Oct 19 14:33:00.580540 kernel: device-mapper: table: 254:2: verity: Unrecognized verity feature request (-EINVAL)
Oct 19 14:33:00.582535 kernel: device-mapper: ioctl: error adding target to table
Oct 19 14:33:00.583958 systemd-sysext[1742]: device-mapper: reload ioctl on loop7p1-39-verity (254:2) failed: Invalid argument
Oct 19 14:33:00.590188 kernel: device-mapper: verity: sha256 using "sha256-lib"
Oct 19 14:33:00.861118 kernel: erofs (device dm-2): mounted with root inode @ nid 39.
Oct 19 14:33:00.887100 kernel: loop1: detected capacity change from 0 to 156464
Oct 19 14:33:00.902100 kernel: loop3: detected capacity change from 0 to 431832
Oct 19 14:33:00.929662 kernel:  loop3: p1 p2 p3
Oct 19 14:33:00.933783 kernel: device-mapper: verity: sha256 using "sha256-lib"
Oct 19 14:33:00.933828 kernel: device-mapper: verity: Unrecognized verity feature request: root_hash_sig_key_desc
Oct 19 14:33:00.936994 kernel: device-mapper: table: 254:2: verity: Unrecognized verity feature request (-EINVAL)
Oct 19 14:33:00.937028 kernel: device-mapper: ioctl: error adding target to table
Oct 19 14:33:00.937076 (sd-merge)[1771]: device-mapper: reload ioctl on loop3p1-46-verity (254:2) failed: Invalid argument
Oct 19 14:33:00.943112 kernel: device-mapper: verity: sha256 using "sha256-lib"
Oct 19 14:33:00.983119 kernel: erofs (device dm-2): mounted with root inode @ nid 39.
Oct 19 14:33:00.987103 kernel: loop4: detected capacity change from 0 to 135824
Oct 19 14:33:00.998099 kernel:  loop4: p1 p2 p3
Oct 19 14:33:01.006345 kernel: device-mapper: verity: sha256 using "sha256-lib"
Oct 19 14:33:01.006379 kernel: device-mapper: verity: Unrecognized verity feature request: root_hash_sig_key_desc
Oct 19 14:33:01.008733 kernel: device-mapper: table: 254:3: verity: Unrecognized verity feature request (-EINVAL)
Oct 19 14:33:01.010388 kernel: device-mapper: ioctl: error adding target to table
Oct 19 14:33:01.010862 (sd-merge)[1771]: device-mapper: reload ioctl on loop4p1-50-verity (254:3) failed: Invalid argument
Oct 19 14:33:01.018420 kernel: device-mapper: verity: sha256 using "sha256-lib"
Oct 19 14:33:01.055103 kernel: erofs (device dm-3): mounted with root inode @ nid 39.
Oct 19 14:33:01.057104 kernel: loop5: detected capacity change from 0 to 169080
Oct 19 14:33:01.068117 kernel:  loop5: p1 p2 p3
Oct 19 14:33:01.071783 kernel: device-mapper: verity: sha256 using "sha256-lib"
Oct 19 14:33:01.071893 kernel: device-mapper: verity: Unrecognized verity feature request: root_hash_sig_key_desc
Oct 19 14:33:01.073232 kernel: device-mapper: table: 254:4: verity: Unrecognized verity feature request (-EINVAL)
Oct 19 14:33:01.073271 kernel: device-mapper: ioctl: error adding target to table
Oct 19 14:33:01.074111 (sd-merge)[1771]: device-mapper: reload ioctl on loop5p1-54-verity (254:4) failed: Invalid argument
Oct 19 14:33:01.078171 kernel: device-mapper: verity: sha256 using "sha256-lib"
Oct 19 14:33:01.107962 (sd-merge)[1771]: Using extensions 'containerd-flatcar.raw', 'docker-flatcar.raw', 'ig.raw', 'oem-azure-9999.9.9+enable-nvidia-580-2.raw'.
Oct 19 14:33:01.113199 kernel: erofs (device dm-4): mounted with root inode @ nid 39.
Oct 19 14:33:01.109238 (sd-merge)[1771]: Merged extensions into '/sysroot/usr'.
Oct 19 14:33:01.113228 systemd[1]: Finished initrd-setup-root-after-ignition.service - Root filesystem completion.
Oct 19 14:33:01.115000 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'
Oct 19 14:33:01.121289 kernel: audit: type=1130 audit(1792420381.115:42): 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'
Oct 19 14:33:01.120401 systemd[1]: Starting initrd-parse-etc.service - Mountpoints Configured in the Real Root...
Oct 19 14:33:01.143097 systemd[1]: initrd-parse-etc.service: Deactivated successfully.
Oct 19 14:33:01.145000 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'
Oct 19 14:33:01.143214 systemd[1]: Finished initrd-parse-etc.service - Mountpoints Configured in the Real Root.
Oct 19 14:33:01.145000 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'
Oct 19 14:33:01.156732 kernel: audit: type=1130 audit(1792420381.145:43): 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'
Oct 19 14:33:01.146189 systemd[1]: initrd-parse-etc.service: Triggering OnSuccess= dependencies.
Oct 19 14:33:01.158178 kernel: audit: type=1131 audit(1792420381.145:44): 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'
Oct 19 14:33:01.146369 systemd[1]: Reached target initrd-fs.target - Initrd File Systems.
Oct 19 14:33:01.158282 systemd[1]: dracut-mount.service - dracut mount hook skipped, no trigger condition checks were met.
Oct 19 14:33:01.159007 systemd[1]: Starting dracut-pre-pivot.service - dracut pre-pivot and cleanup hook...
Oct 19 14:33:01.179259 systemd[1]: Finished dracut-pre-pivot.service - dracut pre-pivot and cleanup hook.
Oct 19 14:33:01.180000 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'
Oct 19 14:33:01.186316 systemd[1]: Starting initrd-cleanup.service - Cleaning Up and Shutting Down Daemons...
Oct 19 14:33:01.190414 kernel: audit: type=1130 audit(1792420381.180:45): 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'
Oct 19 14:33:01.202763 systemd[1]: Stopped target ignition-diskful.target - Ignition Boot Disk Setup.
Oct 19 14:33:01.202974 systemd[1]: Stopped target initrd-root-device.target - Initrd Root Device.
Oct 19 14:33:01.210000 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'
Oct 19 14:33:01.220363 kernel: audit: type=1131 audit(1792420381.210:46): 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'
Oct 19 14:33:01.203230 systemd[1]: Stopped target initrd-usr-fs.target - Initrd /usr File System.
Oct 19 14:33:01.203467 systemd[1]: Stopped target nss-lookup.target - Host and Network Name Lookups.
Oct 19 14:33:01.210180 systemd[1]: Stopped target remote-cryptsetup.target - Remote Encrypted Volumes.
Oct 19 14:33:01.228000 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'
Oct 19 14:33:01.235377 kernel: audit: type=1131 audit(1792420381.228:47): 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'
Oct 19 14:33:01.210712 systemd[1]: Stopped target timers.target - Timer Units.
Oct 19 14:33:01.210937 systemd[1]: systemd-coredump.socket: Deactivated successfully.
Oct 19 14:33:01.211035 systemd[1]: Closed systemd-coredump.socket - Process Core Dump Socket.
Oct 19 14:33:01.211264 systemd[1]: dracut-pre-pivot.service: Deactivated successfully.
Oct 19 14:33:01.211361 systemd[1]: Stopped dracut-pre-pivot.service - dracut pre-pivot and cleanup hook.
Oct 19 14:33:01.211804 systemd[1]: Stopped target remote-fs.target - Remote File Systems.
Oct 19 14:33:01.221233 systemd[1]: Stopped target remote-fs-pre.target - Preparation for Remote File Systems.
Oct 19 14:33:01.225200 systemd[1]: dracut-pre-mount.service: Deactivated successfully.
Oct 19 14:33:01.225315 systemd[1]: Stopped dracut-pre-mount.service - dracut pre-mount hook.
Oct 19 14:33:01.229387 systemd[1]: Stopped target basic.target - Basic System.
Oct 19 14:33:01.238275 systemd[1]: Stopped target paths.target - Path Units.
Oct 19 14:33:01.241237 systemd[1]: Stopped target slices.target - Slice Units.
Oct 19 14:33:01.246233 systemd[1]: Stopped target sockets.target - Socket Units.
Oct 19 14:33:01.248446 systemd[1]: Stopped target sysinit.target - System Initialization.
Oct 19 14:33:01.252230 systemd[1]: Stopped target cryptsetup.target - Local Encrypted Volumes.
Oct 19 14:33:01.256184 systemd[1]: systemd-ask-password-console.path: Deactivated successfully.
Oct 19 14:33:01.256542 systemd[1]: Stopped systemd-ask-password-console.path - Dispatch Password Requests to Console Directory Watch.
Oct 19 14:33:01.258019 systemd[1]: Stopped target cryptsetup-pre.target - Local Encrypted Volumes (Pre).
Oct 19 14:33:01.258521 systemd[1]: clevis-luks-askpass.path: Deactivated successfully.
Oct 19 14:33:01.258880 systemd[1]: Stopped clevis-luks-askpass.path - Forward Password Requests to Clevis Directory Watch.
Oct 19 14:33:01.259462 systemd[1]: Stopped target local-fs.target - Local File Systems.
Oct 19 14:33:01.281816 systemd[1]: Stopped target local-fs-pre.target - Preparation for Local File Systems.
Oct 19 14:33:01.281996 systemd[1]: Stopped target swap.target - Swaps.
Oct 19 14:33:01.282168 systemd[1]: iscsid.socket: Deactivated successfully.
Oct 19 14:33:01.282285 systemd[1]: Closed iscsid.socket - Open-iSCSI iscsid Socket.
Oct 19 14:33:01.282501 systemd[1]: iscsiuio.socket: Deactivated successfully.
Oct 19 14:33:01.282572 systemd[1]: Closed iscsiuio.socket - Open-iSCSI iscsiuio Socket.
Oct 19 14:33:01.291325 systemd[1]: systemd-journald-audit.socket: Deactivated successfully.
Oct 19 14:33:01.291396 systemd[1]: Closed systemd-journald-audit.socket - Journal Audit Socket.
Oct 19 14:33:01.301339 systemd[1]: dracut-initqueue.service: Deactivated successfully.
Oct 19 14:33:01.301431 systemd[1]: Stopped dracut-initqueue.service - dracut initqueue hook.
Oct 19 14:33:01.308000 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'
Oct 19 14:33:01.309430 systemd[1]: initrd-setup-root-after-ignition.service: Deactivated successfully.
Oct 19 14:33:01.309903 systemd[1]: Stopped initrd-setup-root-after-ignition.service - Root filesystem completion.
Oct 19 14:33:01.314652 kernel: audit: type=1131 audit(1792420381.308:48): 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'
Oct 19 14:33:01.317000 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'
Oct 19 14:33:01.318282 systemd[1]: ignition-files.service: Deactivated successfully.
Oct 19 14:33:01.318657 systemd[1]: Stopped ignition-files.service - Ignition (files).
Oct 19 14:33:01.321154 kernel: audit: type=1131 audit(1792420381.317:49): 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'
Oct 19 14:33:01.323000 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'
Oct 19 14:33:01.324520 systemd[1]: flatcar-metadata-hostname.service: Deactivated successfully.
Oct 19 14:33:01.325045 systemd[1]: Stopped flatcar-metadata-hostname.service - Flatcar Metadata Hostname Agent.
Oct 19 14:33:01.329000 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'
Oct 19 14:33:01.334608 kernel: audit: type=1131 audit(1792420381.323:50): 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'
Oct 19 14:33:01.334628 kernel: audit: type=1131 audit(1792420381.329:51): 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'
Oct 19 14:33:01.335236 systemd[1]: Stopping ignition-mount.service - Ignition (mount)...
Oct 19 14:33:01.336000 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'
Oct 19 14:33:01.336000 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'
Oct 19 14:33:01.337000 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'
Oct 19 14:33:01.339000 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'
Oct 19 14:33:01.336365 systemd[1]: systemd-modules-load.service: Deactivated successfully.
Oct 19 14:33:01.336469 systemd[1]: Stopped systemd-modules-load.service - Load Kernel Modules.
Oct 19 14:33:01.336732 systemd[1]: systemd-tmpfiles-setup.service: Deactivated successfully.
Oct 19 14:33:01.355281 ignition[1807]: INFO     : Ignition 2.27.0
Oct 19 14:33:01.355281 ignition[1807]: INFO     : Stage: umount
Oct 19 14:33:01.355281 ignition[1807]: INFO     : no config dir at "/run/ignition/base.d"
Oct 19 14:33:01.355281 ignition[1807]: INFO     : no config dir at "/etc/ignition/base.d"
Oct 19 14:33:01.355281 ignition[1807]: INFO     : no config dir at "/usr/lib/ignition/base.d"
Oct 19 14:33:01.355281 ignition[1807]: INFO     : no configs found in "base.d" across system config directories
Oct 19 14:33:01.355281 ignition[1807]: INFO     : no config dir at "/run/ignition/base.platform.d/azure"
Oct 19 14:33:01.355281 ignition[1807]: INFO     : no config dir at "/etc/ignition/base.platform.d/azure"
Oct 19 14:33:01.355281 ignition[1807]: INFO     : no config dir at "/usr/lib/ignition/base.platform.d/azure"
Oct 19 14:33:01.355281 ignition[1807]: INFO     : no configs found in "base.platform.d/azure" across system config directories
Oct 19 14:33:01.355281 ignition[1807]: INFO     : umount: umount passed
Oct 19 14:33:01.355281 ignition[1807]: INFO     : Ignition finished successfully
Oct 19 14:33:01.336807 systemd[1]: Stopped systemd-tmpfiles-setup.service - Create System Files and Directories.
Oct 19 14:33:01.336982 systemd[1]: systemd-udev-trigger.service: Deactivated successfully.
Oct 19 14:33:01.337051 systemd[1]: Stopped systemd-udev-trigger.service - Coldplug All udev Devices.
Oct 19 14:33:01.339224 systemd[1]: dracut-pre-trigger.service: Deactivated successfully.
Oct 19 14:33:01.339315 systemd[1]: Stopped dracut-pre-trigger.service - dracut pre-trigger hook.
Oct 19 14:33:01.348848 systemd[1]: initrd-cleanup.service: Deactivated successfully.
Oct 19 14:33:01.348975 systemd[1]: Finished initrd-cleanup.service - Cleaning Up and Shutting Down Daemons.
Oct 19 14:33:01.380000 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'
Oct 19 14:33:01.380000 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'
Oct 19 14:33:01.381432 systemd[1]: ignition-mount.service: Deactivated successfully.
Oct 19 14:33:01.381000 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'
Oct 19 14:33:01.381535 systemd[1]: Stopped ignition-mount.service - Ignition (mount).
Oct 19 14:33:01.385503 systemd[1]: Stopped target network.target - Network.
Oct 19 14:33:01.390452 systemd[1]: ignition-disks.service: Deactivated successfully.
Oct 19 14:33:01.390491 systemd[1]: Stopped ignition-disks.service - Ignition (disks).
Oct 19 14:33:01.394000 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'
Oct 19 14:33:01.395675 systemd[1]: ignition-setup-pre.service: Deactivated successfully.
Oct 19 14:33:01.397000 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'
Oct 19 14:33:01.395704 systemd[1]: Stopped ignition-setup-pre.service - Ignition env setup.
Oct 19 14:33:01.401000 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'
Oct 19 14:33:01.398168 systemd[1]: initrd-setup-root.service: Deactivated successfully.
Oct 19 14:33:01.398197 systemd[1]: Stopped initrd-setup-root.service - Root filesystem setup.
Oct 19 14:33:01.402289 systemd-networkd[1275]: eth0: DHCP lease lost
Oct 19 14:33:01.402469 systemd[1]: Stopping systemd-networkd.service - Network Management...
Oct 19 14:33:01.403075 systemd[1]: Stopping systemd-resolved.service - Network Name Resolution...
Oct 19 14:33:01.416174 systemd[1]: systemd-resolved.service: Deactivated successfully.
Oct 19 14:33:01.422000 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'
Oct 19 14:33:01.416284 systemd[1]: Stopped systemd-resolved.service - Network Name Resolution.
Oct 19 14:33:01.425004 systemd[1]: systemd-networkd.service: Deactivated successfully.
Oct 19 14:33:01.425118 systemd[1]: Stopped systemd-networkd.service - Network Management.
Oct 19 14:33:01.428000 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'
Oct 19 14:33:01.430000 audit: BPF prog-id=8 op=UNLOAD
Oct 19 14:33:01.431941 systemd[1]: systemd-networkd-resolve-hook.socket: Deactivated successfully.
Oct 19 14:33:01.430000 audit: BPF prog-id=5 op=UNLOAD
Oct 19 14:33:01.431994 systemd[1]: Closed systemd-networkd-resolve-hook.socket - Network Management Resolve Hook Socket.
Oct 19 14:33:01.435391 systemd[1]: Stopped target network-pre.target - Preparation for Network.
Oct 19 14:33:01.439555 systemd[1]: systemd-networkd.socket: Deactivated successfully.
Oct 19 14:33:01.439605 systemd[1]: Closed systemd-networkd.socket - Network Management Netlink Socket.
Oct 19 14:33:01.443607 systemd[1]: Stopping network-cleanup.service - Network Cleanup...
Oct 19 14:33:01.450241 systemd[1]: Stopping systemd-udevd.service - Rule-based Manager for Device Events and Files...
Oct 19 14:33:01.461282 systemd[1]: systemd-udevd.service: Deactivated successfully.
Oct 19 14:33:01.461453 systemd[1]: Stopped systemd-udevd.service - Rule-based Manager for Device Events and Files.
Oct 19 14:33:01.465000 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'
Oct 19 14:33:01.466350 systemd[1]: systemd-udevd-control.socket: Deactivated successfully.
Oct 19 14:33:01.466393 systemd[1]: Closed systemd-udevd-control.socket - udev Control Socket.
Oct 19 14:33:01.468686 systemd[1]: systemd-udevd-varlink.socket: Deactivated successfully.
Oct 19 14:33:01.468738 systemd[1]: Closed systemd-udevd-varlink.socket - udev Varlink Socket.
Oct 19 14:33:01.471903 systemd[1]: dracut-pre-udev.service: Deactivated successfully.
Oct 19 14:33:01.471933 systemd[1]: Stopped dracut-pre-udev.service - dracut pre-udev hook.
Oct 19 14:33:01.478000 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'
Oct 19 14:33:01.480049 systemd[1]: dracut-cmdline.service: Deactivated successfully.
Oct 19 14:33:01.480092 systemd[1]: Stopped dracut-cmdline.service - dracut cmdline hook.
Oct 19 14:33:01.482000 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'
Oct 19 14:33:01.483895 systemd[1]: dracut-cmdline-ask.service: Deactivated successfully.
Oct 19 14:33:01.486000 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'
Oct 19 14:33:01.483921 systemd[1]: Stopped dracut-cmdline-ask.service - dracut ask for additional cmdline parameters.
Oct 19 14:33:01.488726 systemd[1]: Starting initrd-udevadm-cleanup-db.service - Cleanup udev Database...
Oct 19 14:33:01.490000 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'
Oct 19 14:33:01.490000 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'
Oct 19 14:33:01.491348 systemd[1]: systemd-network-generator.service: Deactivated successfully.
Oct 19 14:33:01.491385 systemd[1]: Stopped systemd-network-generator.service - Generate Network Units from Kernel Command Line.
Oct 19 14:33:01.491575 systemd[1]: systemd-tmpfiles-setup-dev.service: Deactivated successfully.
Oct 19 14:33:01.503000 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'
Oct 19 14:33:01.491599 systemd[1]: Stopped systemd-tmpfiles-setup-dev.service - Create Static Device Nodes in /dev.
Oct 19 14:33:01.507000 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'
Oct 19 14:33:01.491827 systemd[1]: systemd-tmpfiles-setup-dev-early.service: Deactivated successfully.
Oct 19 14:33:01.512000 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'
Oct 19 14:33:01.491848 systemd[1]: Stopped systemd-tmpfiles-setup-dev-early.service - Create Static Device Nodes in /dev gracefully.
Oct 19 14:33:01.518000 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'
Oct 19 14:33:01.519000 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'
Oct 19 14:33:01.504628 systemd[1]: kmod-static-nodes.service: Deactivated successfully.
Oct 19 14:33:01.504657 systemd[1]: Stopped kmod-static-nodes.service - Create List of Static Device Nodes.
Oct 19 14:33:01.508905 systemd[1]: systemd-vconsole-setup.service: Deactivated successfully.
Oct 19 14:33:01.508940 systemd[1]: Stopped systemd-vconsole-setup.service - Virtual Console Setup.
Oct 19 14:33:01.514766 systemd[1]: initrd-udevadm-cleanup-db.service: Deactivated successfully.
Oct 19 14:33:01.532475 kernel: hv_netvsc f8615163-0000-1000-2000-000d3ad9e1b2 eth0: Data path switched from VF: enP30832s1
Oct 19 14:33:01.516136 systemd[1]: Finished initrd-udevadm-cleanup-db.service - Cleanup udev Database.
Oct 19 14:33:01.534061 kernel: mana 7870:00:00.0 enP30832s1: Configured steering vPort 0 entries 64
Oct 19 14:33:01.534783 systemd[1]: network-cleanup.service: Deactivated successfully.
Oct 19 14:33:01.534899 systemd[1]: Stopped network-cleanup.service - Network Cleanup.
Oct 19 14:33:01.537000 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'
Oct 19 14:33:01.537953 systemd[1]: Reached target initrd-switch-root.target - Switch Root.
Oct 19 14:33:01.542660 systemd[1]: Starting initrd-switch-root.service - Switch Root...
Oct 19 14:33:01.556276 systemd[1]: Switching root.
Oct 19 14:33:01.615396 systemd-journald[1085]: Journal stopped
Oct 19 14:33:07.056209 systemd-journald[1085]: Received SIGTERM from PID 1 (systemd).
Oct 19 14:33:07.056240 kernel: SELinux:  policy capability network_peer_controls=1
Oct 19 14:33:07.056253 kernel: SELinux:  policy capability open_perms=1
Oct 19 14:33:07.056262 kernel: SELinux:  policy capability extended_socket_class=1
Oct 19 14:33:07.056272 kernel: SELinux:  policy capability always_check_network=0
Oct 19 14:33:07.056281 kernel: SELinux:  policy capability cgroup_seclabel=1
Oct 19 14:33:07.056291 kernel: SELinux:  policy capability nnp_nosuid_transition=1
Oct 19 14:33:07.056301 kernel: SELinux:  policy capability genfs_seclabel_symlinks=0
Oct 19 14:33:07.056311 kernel: SELinux:  policy capability ioctl_skip_cloexec=0
Oct 19 14:33:07.056322 kernel: SELinux:  policy capability userspace_initial_context=0
Oct 19 14:33:07.056332 kernel: SELinux:  policy capability netlink_xperm=0
Oct 19 14:33:07.056340 kernel: SELinux:  policy capability netif_wildcard=0
Oct 19 14:33:07.056349 kernel: SELinux:  policy capability genfs_seclabel_wildcard=0
Oct 19 14:33:07.056358 kernel: SELinux:  policy capability functionfs_seclabel=0
Oct 19 14:33:07.056370 systemd[1]: Successfully loaded SELinux policy in 158.899ms.
Oct 19 14:33:07.056383 systemd[1]: Relabeled /dev/, /dev/shm/, /run/ in 5.564ms.
Oct 19 14:33:07.056395 systemd[1]: systemd 261.2 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)
Oct 19 14:33:07.056406 systemd[1]: Detected virtualization microsoft.
Oct 19 14:33:07.056425 systemd[1]: Detected architecture x86-64.
Oct 19 14:33:07.056440 systemd[1]: Detected first boot.
Oct 19 14:33:07.056457 systemd[1]: Initializing machine ID from random generator.
Oct 19 14:33:07.056470 systemd[1]: Hostname set to <ci-9999.9.9-e-dd7c10426c>.
Oct 19 14:33:07.056481 zram_generator::config[1849]: No configuration found.
Oct 19 14:33:07.056496 kernel: Guest personality initialized and is inactive
Oct 19 14:33:07.056508 kernel: VMCI host device registered (name=vmci, major=10, minor=259)
Oct 19 14:33:07.056525 kernel: Initialized host personality
Oct 19 14:33:07.056537 kernel: NET: Registered PF_VSOCK protocol family
Oct 19 14:33:07.056549 systemd[1]: Applying preset policy.
Oct 19 14:33:07.056564 systemd[1]: Created symlink '/etc/systemd/system/timers.target.wants/google-oslogin-cache.timer' → '/usr/lib/systemd/system/google-oslogin-cache.timer'.
Oct 19 14:33:07.056579 systemd[1]: Populated /etc with preset unit settings.
Oct 19 14:33:07.056597 kernel: kauditd_printk_skb: 30 callbacks suppressed
Oct 19 14:33:07.056610 kernel: audit: type=1334 audit(1792420386.562:82): prog-id=10 op=LOAD
Oct 19 14:33:07.056627 kernel: audit: type=1334 audit(1792420386.562:83): prog-id=2 op=UNLOAD
Oct 19 14:33:07.056640 kernel: audit: type=1334 audit(1792420386.562:84): prog-id=11 op=LOAD
Oct 19 14:33:07.056653 kernel: audit: type=1334 audit(1792420386.562:85): prog-id=12 op=LOAD
Oct 19 14:33:07.056663 kernel: audit: type=1334 audit(1792420386.562:86): prog-id=3 op=UNLOAD
Oct 19 14:33:07.056676 kernel: audit: type=1334 audit(1792420386.562:87): prog-id=4 op=UNLOAD
Oct 19 14:33:07.056688 kernel: audit: type=1334 audit(1792420386.564:88): prog-id=13 op=LOAD
Oct 19 14:33:07.056698 kernel: audit: type=1334 audit(1792420386.564:89): prog-id=10 op=UNLOAD
Oct 19 14:33:07.056712 kernel: audit: type=1334 audit(1792420386.564:90): prog-id=14 op=LOAD
Oct 19 14:33:07.056729 kernel: audit: type=1334 audit(1792420386.564:91): prog-id=15 op=LOAD
Oct 19 14:33:07.056742 systemd[1]: initrd-switch-root.service: Deactivated successfully.
Oct 19 14:33:07.056753 systemd[1]: Stopped initrd-switch-root.service - Switch Root.
Oct 19 14:33:07.056768 systemd[1]: systemd-journald.service: Scheduled restart job, restart counter is at 1.
Oct 19 14:33:07.056782 systemd[1]: Created slice system-addon\x2dconfig.slice - Slice /system/addon-config.
Oct 19 14:33:07.056800 systemd[1]: Created slice system-addon\x2drun.slice - Slice /system/addon-run.
Oct 19 14:33:07.056812 systemd[1]: Created slice system-getty.slice - Slice /system/getty.
Oct 19 14:33:07.056828 systemd[1]: Created slice system-modprobe.slice - Slice /system/modprobe.
Oct 19 14:33:07.056841 systemd[1]: Created slice system-serial\x2dgetty.slice - Slice /system/serial-getty.
Oct 19 14:33:07.056855 systemd[1]: Created slice system-system\x2dcloudinit.slice - Slice /system/system-cloudinit.
Oct 19 14:33:07.056869 systemd[1]: Created slice system-systemd\x2dfsck.slice - Slice /system/systemd-fsck.
Oct 19 14:33:07.056887 systemd[1]: Created slice user.slice - User and Session Slice.
Oct 19 14:33:07.056905 systemd[1]: Started clevis-luks-askpass.path - Forward Password Requests to Clevis Directory Watch.
Oct 19 14:33:07.056920 systemd[1]: Started systemd-ask-password-console.path - Dispatch Password Requests to Console Directory Watch.
Oct 19 14:33:07.056934 systemd[1]: Started systemd-ask-password-wall.path - Forward Password Requests to Wall Directory Watch.
Oct 19 14:33:07.056946 systemd[1]: Set up automount boot.automount - Boot partition Automount Point.
Oct 19 14:33:07.056956 systemd[1]: Set up automount proc-sys-fs-binfmt_misc.automount - Arbitrary Executable File Formats File System Automount Point.
Oct 19 14:33:07.056968 systemd[1]: Expecting device dev-disk-by\x2dlabel-OEM.device - /dev/disk/by-label/OEM...
Oct 19 14:33:07.056978 systemd[1]: Expecting device dev-ptp_hyperv.device - /dev/ptp_hyperv...
Oct 19 14:33:07.056987 systemd[1]: Expecting device dev-ttyS0.device - /dev/ttyS0...
Oct 19 14:33:07.056997 systemd[1]: Reached target cryptsetup-pre.target - Local Encrypted Volumes (Pre).
Oct 19 14:33:07.057007 systemd[1]: Reached target cryptsetup.target - Local Encrypted Volumes.
Oct 19 14:33:07.057017 systemd[1]: Reached target imports.target - Image Downloads.
Oct 19 14:33:07.057027 systemd[1]: Stopped target initrd-switch-root.target - Switch Root.
Oct 19 14:33:07.057039 systemd[1]: Stopped target initrd-fs.target - Initrd File Systems.
Oct 19 14:33:07.057050 systemd[1]: Stopped target initrd-root-fs.target - Initrd Root File System.
Oct 19 14:33:07.057061 systemd[1]: Reached target integritysetup.target - Local Integrity Protected Volumes.
Oct 19 14:33:07.057072 systemd[1]: Reached target remote-cryptsetup.target - Remote Encrypted Volumes.
Oct 19 14:33:07.057098 systemd[1]: Reached target remote-fs.target - Remote File Systems.
Oct 19 14:33:07.057109 systemd[1]: Reached target remote-integritysetup.target - Remote Integrity Protected Volumes.
Oct 19 14:33:07.057122 systemd[1]: Reached target remote-veritysetup.target - Remote Verity Protected Volumes.
Oct 19 14:33:07.057133 systemd[1]: Reached target slices.target - Slice Units.
Oct 19 14:33:07.057145 systemd[1]: Reached target swap.target - Swaps.
Oct 19 14:33:07.057156 systemd[1]: Reached target veritysetup.target - Local Verity Protected Volumes.
Oct 19 14:33:07.057169 systemd[1]: Listening on systemd-ask-password.socket - Query the User Interactively for a Password.
Oct 19 14:33:07.057180 systemd[1]: Listening on systemd-coredump.socket - Process Core Dump Socket.
Oct 19 14:33:07.057191 systemd[1]: Listening on systemd-creds.socket - Credential Encryption/Decryption.
Oct 19 14:33:07.057201 systemd[1]: Listening on systemd-factory-reset.socket - Factory Reset Management.
Oct 19 14:33:07.057212 systemd[1]: Listening on systemd-hostnamed.socket - Hostname Service Socket.
Oct 19 14:33:07.057223 systemd[1]: Listening on systemd-journald-audit.socket - Journal Audit Socket.
Oct 19 14:33:07.057234 systemd[1]: Listening on systemd-mountfsd.socket - DDI File System Mounter Socket.
Oct 19 14:33:07.057247 systemd[1]: Listening on systemd-mute-console.socket - Console Output Muting Service Socket.
Oct 19 14:33:07.057258 systemd[1]: Listening on systemd-networkd-varlink-metrics.socket - Network Management Metrics Varlink Socket.
Oct 19 14:33:07.057268 systemd[1]: Listening on systemd-networkd-varlink.socket - Network Management Varlink Socket.
Oct 19 14:33:07.057279 systemd[1]: Listening on systemd-networkd.socket - Network Management Netlink Socket.
Oct 19 14:33:07.057289 systemd[1]: Listening on systemd-nsresourced.socket - Namespace Resource Manager Socket.
Oct 19 14:33:07.057300 systemd[1]: Listening on systemd-oomd.socket - Userspace Out-Of-Memory (OOM) Killer Socket.
Oct 19 14:33:07.057311 systemd[1]: Listening on systemd-repart.socket - Disk Repartitioning Service Socket.
Oct 19 14:33:07.057324 systemd[1]: Listening on systemd-report-basic.socket - Report System Basic Metrics Socket.
Oct 19 14:33:07.057335 systemd[1]: Listening on systemd-report-cgroup.socket - CGroup Report Varlink Socket.
Oct 19 14:33:07.057345 systemd[1]: Listening on systemd-resolved-monitor.socket - Resolve Monitor Varlink Socket.
Oct 19 14:33:07.057356 systemd[1]: Listening on systemd-resolved-varlink.socket - Resolve Service Varlink Socket.
Oct 19 14:33:07.057366 systemd[1]: Listening on systemd-storage-block.socket - Simple Block Device Backed Storage Provider.
Oct 19 14:33:07.057379 systemd[1]: Listening on systemd-storage-fs.socket - Simple File System Backed Storage Provider.
Oct 19 14:33:07.057392 systemd[1]: Listening on systemd-udevd-control.socket - udev Control Socket.
Oct 19 14:33:07.057403 systemd[1]: Listening on systemd-udevd-varlink.socket - udev Varlink Socket.
Oct 19 14:33:07.057414 systemd[1]: Listening on systemd-userdbd.socket - User Database Manager Socket.
Oct 19 14:33:07.057425 systemd[1]: Mounting dev-hugepages.mount - Huge Pages File System...
Oct 19 14:33:07.057435 systemd[1]: Mounting dev-mqueue.mount - POSIX Message Queue File System...
Oct 19 14:33:07.057446 systemd[1]: Mounting media.mount - External Media Directory...
Oct 19 14:33:07.057457 systemd[1]: proc-xen.mount - /proc/xen skipped, unmet condition check ConditionVirtualization=xen
Oct 19 14:33:07.057469 systemd[1]: Mounting sys-kernel-debug.mount - Kernel Debug File System...
Oct 19 14:33:07.057481 systemd[1]: Mounting sys-kernel-tracing.mount - Kernel Trace File System...
Oct 19 14:33:07.057492 systemd[1]: tmp.mount: x-systemd.graceful-option=usrquota specified, but option is not available, suppressing.
Oct 19 14:33:07.057502 systemd[1]: Mounting tmp.mount - Temporary Directory /tmp...
Oct 19 14:33:07.057512 systemd[1]: Starting flatcar-tmpfiles.service - Create missing system files...
Oct 19 14:33:07.057523 systemd[1]: ignition-delete-config.service - Ignition (delete config) skipped, no trigger condition checks were met.
Oct 19 14:33:07.057534 systemd[1]: Starting kmod-static-nodes.service - Create List of Static Device Nodes...
Oct 19 14:33:07.057547 systemd[1]: Starting modprobe@configfs.service - Load Kernel Module configfs...
Oct 19 14:33:07.057558 systemd[1]: modprobe@drm.service - Load Kernel Module drm skipped, unmet condition check ConditionKernelModuleLoaded=!drm
Oct 19 14:33:07.057569 systemd[1]: modprobe@efi_pstore.service - Load Kernel Module efi_pstore skipped, unmet condition check ConditionKernelModuleLoaded=!efi_pstore
Oct 19 14:33:07.057580 systemd[1]: Starting modprobe@fuse.service - Load Kernel Module fuse...
Oct 19 14:33:07.057591 systemd[1]: setup-nsswitch.service - Create /etc/nsswitch.conf skipped, unmet condition check ConditionPathExists=!/etc/nsswitch.conf
Oct 19 14:33:07.057601 systemd[1]: systemd-fsck-root.service: Deactivated successfully.
Oct 19 14:33:07.057615 systemd[1]: Stopped systemd-fsck-root.service - File System Check on Root Device.
Oct 19 14:33:07.057627 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
Oct 19 14:33:07.057638 systemd[1]: Starting systemd-journald.service - Journal Service...
Oct 19 14:33:07.057649 systemd[1]: Starting systemd-modules-load.service - Load Kernel Modules...
Oct 19 14:33:07.057664 systemd[1]: Starting systemd-network-generator.service - Generate Network Units from Kernel Command Line...
Oct 19 14:33:07.057676 systemd[1]: Reached target time-set.target - System Time Set.
Oct 19 14:33:07.057688 systemd[1]: Starting systemd-remount-fs.service - Remount Root and Kernel File Systems...
Oct 19 14:33:07.057777 systemd[1]: Starting systemd-udev-load-credentials.service - Load udev Rules from Credentials...
Oct 19 14:33:07.057791 systemd[1]: Starting systemd-udev-trigger.service - Coldplug All udev Devices...
Oct 19 14:33:07.057803 systemd[1]: xenserver-pv-version.service - Set fake PV driver version for XenServer skipped, unmet condition check ConditionVirtualization=xen
Oct 19 14:33:07.057814 systemd[1]: Mounted dev-hugepages.mount - Huge Pages File System.
Oct 19 14:33:07.057824 systemd[1]: Mounted dev-mqueue.mount - POSIX Message Queue File System.
Oct 19 14:33:07.057852 systemd-journald[1925]: Collecting audit messages is enabled.
Oct 19 14:33:07.057879 systemd[1]: Mounted media.mount - External Media Directory.
Oct 19 14:33:07.057895 systemd-journald[1925]: Journal started
Oct 19 14:33:07.057919 systemd-journald[1925]: Runtime Journal (/run/log/journal/c60c5546fefc4d5e8dbd84281e4fa136) is 8M, max 158.4M, 150.4M free.
Oct 19 14:33:06.785000 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
Oct 19 14:33:06.982000 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'
Oct 19 14:33:06.985000 audit: BPF prog-id=18 op=UNLOAD
Oct 19 14:33:06.985000 audit: BPF prog-id=17 op=UNLOAD
Oct 19 14:33:06.985000 audit: BPF prog-id=19 op=LOAD
Oct 19 14:33:06.985000 audit: BPF prog-id=20 op=LOAD
Oct 19 14:33:06.985000 audit: BPF prog-id=21 op=LOAD
Oct 19 14:33:07.053000 audit: CONFIG_CHANGE op=set audit_enabled=1 old=1 auid=4294967295 ses=4294967295 subj=system_u:system_r:kernel_t:s0 res=1
Oct 19 14:33:07.053000 audit[1925]: SYSCALL arch=c000003e syscall=46 success=yes exit=60 a0=6 a1=7ffeec3e98c0 a2=4000 a3=0 items=0 ppid=1 pid=1925 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)
Oct 19 14:33:07.053000 audit: PROCTITLE proctitle="/usr/lib/systemd/systemd-journald"
Oct 19 14:33:06.556433 systemd[1]: Queued start job for default target multi-user.target.
Oct 19 14:33:06.567255 systemd[1]: Unnecessary job was removed for dev-nvme0n1p6.device - /dev/nvme0n1p6.
Oct 19 14:33:06.567802 systemd[1]: systemd-journald.service: Deactivated successfully.
Oct 19 14:33:07.037600 systemd-modules-load[1926]: Using 2 probe threads
Oct 19 14:33:07.061294 systemd[1]: Started systemd-journald.service - Journal Service.
Oct 19 14:33:07.061000 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'
Oct 19 14:33:07.062862 systemd[1]: Mounted sys-kernel-debug.mount - Kernel Debug File System.
Oct 19 14:33:07.064647 systemd[1]: Mounted sys-kernel-tracing.mount - Kernel Trace File System.
Oct 19 14:33:07.066446 systemd[1]: Mounted tmp.mount - Temporary Directory /tmp.
Oct 19 14:33:07.067527 systemd[1]: Finished kmod-static-nodes.service - Create List of Static Device Nodes.
Oct 19 14:33:07.069000 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'
Oct 19 14:33:07.070325 systemd[1]: modprobe@configfs.service: Deactivated successfully.
Oct 19 14:33:07.070482 systemd[1]: Finished modprobe@configfs.service - Load Kernel Module configfs.
Oct 19 14:33:07.072000 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'
Oct 19 14:33:07.072000 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'
Oct 19 14:33:07.074187 systemd[1]: Finished systemd-network-generator.service - Generate Network Units from Kernel Command Line.
Oct 19 14:33:07.077000 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'
Oct 19 14:33:07.079575 systemd[1]: Finished systemd-remount-fs.service - Remount Root and Kernel File Systems.
Oct 19 14:33:07.082000 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'
Oct 19 14:33:07.092520 systemd[1]: Reached target network-pre.target - Preparation for Network.
Oct 19 14:33:07.096297 systemd[1]: Listening on systemd-networkd-resolve-hook.socket - Network Management Resolve Hook Socket.
Oct 19 14:33:07.098637 kernel: fuse: init (API version 7.45)
Oct 19 14:33:07.100259 systemd[1]: Mounting sys-kernel-config.mount - Kernel Configuration File System...
Oct 19 14:33:07.102501 systemd[1]: remount-root.service - Remount Root File System skipped, unmet condition check ConditionPathIsReadWrite=!/
Oct 19 14:33:07.105159 systemd[1]: Starting systemd-hwdb-update.service - Rebuild Hardware Database...
Oct 19 14:33:07.110245 systemd[1]: Starting systemd-journal-flush.service - Flush Journal to Persistent Storage...
Oct 19 14:33:07.114197 systemd[1]: systemd-pstore.service - Platform Persistent Storage Archival skipped, unmet condition check ConditionDirectoryNotEmpty=/sys/fs/pstore
Oct 19 14:33:07.116015 systemd[1]: Starting systemd-random-seed.service - Load/Save OS Random Seed...
Oct 19 14:33:07.121555 systemd[1]: Starting systemd-tmpfiles-setup-dev-early.service - Create Static Device Nodes in /dev gracefully...
Oct 19 14:33:07.125391 systemd[1]: modprobe@fuse.service: Deactivated successfully.
Oct 19 14:33:07.127537 systemd[1]: Finished modprobe@fuse.service - Load Kernel Module fuse.
Oct 19 14:33:07.131000 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'
Oct 19 14:33:07.131000 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'
Oct 19 14:33:07.132514 systemd[1]: Finished systemd-modules-load.service - Load Kernel Modules.
Oct 19 14:33:07.133000 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'
Oct 19 14:33:07.134909 systemd[1]: Finished systemd-udev-load-credentials.service - Load udev Rules from Credentials.
Oct 19 14:33:07.137000 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'
Oct 19 14:33:07.140711 systemd[1]: Mounted sys-kernel-config.mount - Kernel Configuration File System.
Oct 19 14:33:07.149164 systemd[1]: Mounting sys-fs-fuse-connections.mount - FUSE Control File System...
Oct 19 14:33:07.152207 systemd[1]: Starting systemd-sysctl.service - Apply Kernel Variables...
Oct 19 14:33:07.162268 systemd[1]: Mounted sys-fs-fuse-connections.mount - FUSE Control File System.
Oct 19 14:33:07.162712 systemd-journald[1925]: Time spent on flushing to /var/log/journal/c60c5546fefc4d5e8dbd84281e4fa136 is 342.117ms for 1243 entries.
Oct 19 14:33:07.162712 systemd-journald[1925]: System Journal (/var/log/journal/c60c5546fefc4d5e8dbd84281e4fa136) is 8M, max 2.2G, 2.2G free.
Oct 19 14:33:07.182000 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'
Oct 19 14:33:07.232000 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'
Oct 19 14:33:07.472000 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'
Oct 19 14:33:07.546000 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'
Oct 19 14:33:07.749732 systemd-journald[1925]: Received client request to flush runtime journal.
Oct 19 14:33:07.179599 systemd[1]: Finished systemd-random-seed.service - Load/Save OS Random Seed.
Oct 19 14:33:07.183326 systemd[1]: Reached target first-boot-complete.target - First Boot Complete.
Oct 19 14:33:07.231776 systemd[1]: Finished systemd-udev-trigger.service - Coldplug All udev Devices.
Oct 19 14:33:07.470332 systemd[1]: Finished systemd-sysctl.service - Apply Kernel Variables.
Oct 19 14:33:07.543440 systemd-tmpfiles[1953]: ACLs are not supported, ignoring.
Oct 19 14:33:07.543450 systemd-tmpfiles[1953]: ACLs are not supported, ignoring.
Oct 19 14:33:07.545762 systemd[1]: Finished systemd-tmpfiles-setup-dev-early.service - Create Static Device Nodes in /dev gracefully.
Oct 19 14:33:07.750709 systemd[1]: Finished systemd-journal-flush.service - Flush Journal to Persistent Storage.
Oct 19 14:33:07.752000 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'
Oct 19 14:33:07.859908 systemd[1]: Finished flatcar-tmpfiles.service - Create missing system files.
Oct 19 14:33:07.861000 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'
Oct 19 14:33:07.866180 systemd[1]: Starting systemd-sysusers.service - Create System Users...
Oct 19 14:33:08.078634 systemd[1]: Finished systemd-sysusers.service - Create System Users.
Oct 19 14:33:08.079000 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'
Oct 19 14:33:08.083918 systemd[1]: Starting systemd-journalctl.socket - Journal Log Access Socket...
Oct 19 14:33:08.087000 audit: BPF prog-id=22 op=LOAD
Oct 19 14:33:08.087000 audit: BPF prog-id=23 op=LOAD
Oct 19 14:33:08.087000 audit: BPF prog-id=24 op=LOAD
Oct 19 14:33:08.091166 systemd[1]: Starting systemd-oomd.service - Userspace Out-Of-Memory (OOM) Killer...
Oct 19 14:33:08.093000 audit: BPF prog-id=25 op=LOAD
Oct 19 14:33:08.096177 systemd[1]: Starting systemd-resolved.service - Network Name Resolution...
Oct 19 14:33:08.100182 systemd[1]: Starting systemd-tmpfiles-setup-dev.service - Create Static Device Nodes in /dev...
Oct 19 14:33:08.102568 systemd[1]: Listening on systemd-journalctl.socket - Journal Log Access Socket.
Oct 19 14:33:08.109226 systemd[1]: Starting modprobe@tun.service - Load Kernel Module tun...
Oct 19 14:33:08.111000 audit: BPF prog-id=26 op=LOAD
Oct 19 14:33:08.111000 audit: BPF prog-id=27 op=LOAD
Oct 19 14:33:08.111000 audit: BPF prog-id=28 op=LOAD
Oct 19 14:33:08.116064 systemd[1]: Starting systemd-userdbd.service - User Database Manager...
Oct 19 14:33:08.143954 systemd[1]: proc-sys-fs-binfmt_misc.automount: Got automount request for /proc/sys/fs/binfmt_misc, triggered by 1997 ((systemd-userd))
Oct 19 14:33:08.144961 systemd-tmpfiles[1995]: ACLs are not supported, ignoring.
Oct 19 14:33:08.144983 systemd-tmpfiles[1995]: ACLs are not supported, ignoring.
Oct 19 14:33:08.145091 systemd[1]: Mounting proc-sys-fs-binfmt_misc.mount - Arbitrary Executable File Formats File System...
Oct 19 14:33:08.151312 systemd[1]: Finished systemd-tmpfiles-setup-dev.service - Create Static Device Nodes in /dev.
Oct 19 14:33:08.155000 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'
Oct 19 14:33:08.157879 systemd[1]: Reached target local-fs-pre.target - Preparation for Local File Systems.
Oct 19 14:33:08.161732 systemd[1]: var-lib-machines.mount - Virtual Machine and Container Storage (Compatibility) skipped, unmet condition check ConditionPathExists=/var/lib/machines.raw
Oct 19 14:33:08.161761 systemd[1]: Reached target local-fs.target - Local File Systems.
Oct 19 14:33:08.168757 systemd[1]: Reached target machines.target - Virtual Machines and Containers.
Oct 19 14:33:08.172342 systemd[1]: Listening on systemd-importd.socket - Disk Image Download Service Socket.
Oct 19 14:33:08.175807 systemd[1]: Listening on systemd-sysext.socket - System Extension Image Management.
Oct 19 14:33:08.178117 systemd[1]: Starting systemd-confext.service - Merge System Configuration Images into /etc/...
Oct 19 14:33:08.182162 systemd[1]: Starting systemd-machine-id-commit.service - Save Transient machine-id to Disk...
Oct 19 14:33:08.183620 systemd[1]: systemd-repart.service - Repartition Root Disk skipped, no trigger condition checks were met.
Oct 19 14:33:08.189181 systemd[1]: Starting systemd-userdb-load-credentials.service - Load JSON user/group Records from Credentials...
Oct 19 14:33:08.197618 systemd[1]: Mounted proc-sys-fs-binfmt_misc.mount - Arbitrary Executable File Formats File System.
Oct 19 14:33:08.206905 systemd[1]: systemd-binfmt.service - Set Up Additional Binary Formats skipped, no trigger condition checks were met.
Oct 19 14:33:08.230431 kernel: tun: Universal TUN/TAP device driver, 1.6
Oct 19 14:33:08.230891 systemd[1]: modprobe@tun.service: Deactivated successfully.
Oct 19 14:33:08.231234 systemd[1]: Finished modprobe@tun.service - Load Kernel Module tun.
Oct 19 14:33:08.232000 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'
Oct 19 14:33:08.232000 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'
Oct 19 14:33:08.233000 audit: BPF prog-id=29 op=LOAD
Oct 19 14:33:08.233000 audit: BPF prog-id=30 op=LOAD
Oct 19 14:33:08.233000 audit: BPF prog-id=31 op=LOAD
Oct 19 14:33:08.237631 kernel: loop6: detected capacity change from 0 to 44505
Oct 19 14:33:08.235226 systemd[1]: Starting systemd-nsresourced.service - Namespace Resource Manager...
Oct 19 14:33:08.241959 systemd[1]: Finished systemd-userdb-load-credentials.service - Load JSON user/group Records from Credentials.
Oct 19 14:33:08.244127 kernel:  loop6: p1 p2 p3
Oct 19 14:33:08.243000 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'
Oct 19 14:33:08.246817 systemd[1]: Started systemd-userdbd.service - User Database Manager.
Oct 19 14:33:08.248000 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'
Oct 19 14:33:08.292649 systemd-nsresourced[2009]: Not setting up BPF subsystem, as functionality has been disabled at compile time.
Oct 19 14:33:08.293203 systemd[1]: Started systemd-nsresourced.service - Namespace Resource Manager.
Oct 19 14:33:08.294000 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'
Oct 19 14:33:08.352122 kernel: device-mapper: verity: sha256 using "sha256-lib"
Oct 19 14:33:08.356093 kernel: device-mapper: verity: Unrecognized verity feature request: root_hash_sig_key_desc
Oct 19 14:33:08.358092 kernel: device-mapper: table: 254:5: verity: Unrecognized verity feature request (-EINVAL)
Oct 19 14:33:08.359914 systemd-confext[2006]: device-mapper: reload ioctl on loop6p1-58-verity (254:5) failed: Invalid argument
Oct 19 14:33:08.360199 kernel: device-mapper: ioctl: error adding target to table
Oct 19 14:33:08.368099 kernel: device-mapper: verity: sha256 using "sha256-lib"
Oct 19 14:33:08.413180 systemd-oomd[1993]: No swap; memory pressure usage will be degraded
Oct 19 14:33:08.414370 systemd[1]: Started systemd-oomd.service - Userspace Out-Of-Memory (OOM) Killer.
Oct 19 14:33:08.416000 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'
Oct 19 14:33:08.462904 systemd-resolved[1994]: Positive Trust Anchors:
Oct 19 14:33:08.462920 systemd-resolved[1994]: . IN DS 20326 8 2 e06d44b80b8f1d39a95c0b0d7c65d08458e880409bbc683457104237c7f8ec8d
Oct 19 14:33:08.462923 systemd-resolved[1994]: . IN DS 38696 8 2 683d2d0acb8c9b712a1948b27f741219298d0a450d612c483af444a4c0fb2b16
Oct 19 14:33:08.462956 systemd-resolved[1994]: 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
Oct 19 14:33:08.660349 systemd-resolved[1994]: Using system hostname 'ci-9999.9.9-e-dd7c10426c'.
Oct 19 14:33:08.661385 systemd[1]: Started systemd-resolved.service - Network Name Resolution.
Oct 19 14:33:08.661000 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'
Oct 19 14:33:08.662812 systemd[1]: Reached target nss-lookup.target - Host and Network Name Lookups.
Oct 19 14:33:08.952106 systemd[1]: Finished systemd-hwdb-update.service - Rebuild Hardware Database.
Oct 19 14:33:08.952000 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'
Oct 19 14:33:08.953000 audit: BPF prog-id=7 op=UNLOAD
Oct 19 14:33:08.953000 audit: BPF prog-id=6 op=UNLOAD
Oct 19 14:33:08.953000 audit: BPF prog-id=32 op=LOAD
Oct 19 14:33:08.953000 audit: BPF prog-id=33 op=LOAD
Oct 19 14:33:08.955062 systemd[1]: Starting systemd-udevd.service - Rule-based Manager for Device Events and Files...
Oct 19 14:33:09.035393 systemd[1]: etc-machine\x2did.mount: Deactivated successfully.
Oct 19 14:33:09.035983 systemd[1]: Finished systemd-machine-id-commit.service - Save Transient machine-id to Disk.
Oct 19 14:33:09.036000 audit[1]: SERVICE_START pid=1 uid=0 auid=4294967295 ses=4294967295 subj=system_u:system_r:kernel_t:s0 msg='unit=systemd-machine-id-commit comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success'
Oct 19 14:33:09.164239 systemd-udevd[2028]: Using default interface naming scheme 'v261'.
Oct 19 14:33:09.412449 systemd[1]: Started systemd-udevd.service - Rule-based Manager for Device Events and Files.
Oct 19 14:33:09.413000 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'
Oct 19 14:33:09.415000 audit: BPF prog-id=34 op=LOAD
Oct 19 14:33:09.417154 systemd[1]: Starting systemd-networkd.service - Network Management...
Oct 19 14:33:09.507129 systemd[1]: Condition check resulted in dev-ttyS0.device - /dev/ttyS0 being skipped.
Oct 19 14:33:09.571100 kernel: mousedev: PS/2 mouse device common for all mice
Oct 19 14:33:09.590732 systemd-networkd[2031]: lo: Link UP
Oct 19 14:33:09.590743 systemd-networkd[2031]: lo: Gained carrier
Oct 19 14:33:09.593202 systemd[1]: Started systemd-networkd.service - Network Management.
Oct 19 14:33:09.594000 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'
Oct 19 14:33:09.595366 systemd[1]: Reached target network.target - Network.
Oct 19 14:33:09.600160 systemd[1]: Starting systemd-networkd-persistent-storage.service - Enable Persistent Storage in systemd-networkd...
Oct 19 14:33:09.602263 systemd-networkd[2031]: eth0: Configuring with /usr/lib/systemd/network/zz-default.network.
Oct 19 14:33:09.603486 systemd[1]: Starting systemd-networkd-wait-online.service - Wait for Network to be Online...
Oct 19 14:33:09.608107 kernel: mana 7870:00:00.0 enP30832s1: Configured vPort 0 PD 18 DB 16
Oct 19 14:33:09.612106 kernel: hv_storvsc f8b3781a-1e82-4818-a1c3-63d806ec15bb: tag#83 cmd 0x85 status: scsi 0x2 srb 0x6 host 0xc0000001
Oct 19 14:33:09.619109 kernel: mana 7870:00:00.0 enP30832s1: Configured steering vPort 0 entries 64
Oct 19 14:33:09.624112 kernel: hv_netvsc f8615163-0000-1000-2000-000d3ad9e1b2 eth0: Data path switched to VF: enP30832s1
Oct 19 14:33:09.624814 systemd-networkd[2031]: enP30832s1: Link UP
Oct 19 14:33:09.624819 systemd-networkd[2031]: enP30832s1: Gained carrier
Oct 19 14:33:09.624912 systemd-networkd[2031]: eth0: Link UP
Oct 19 14:33:09.624915 systemd-networkd[2031]: eth0: Gained carrier
Oct 19 14:33:09.636172 systemd-networkd[2031]: eth0: DHCPv4 address 10.0.0.23/24, gateway 10.0.0.1 acquired from 168.63.129.16
Oct 19 14:33:09.662094 kernel: hv_vmbus: registering driver hv_balloon
Oct 19 14:33:09.669107 kernel: hv_balloon: Using Dynamic Memory protocol version 2.0
Oct 19 14:33:09.669385 systemd[1]: Finished systemd-networkd-persistent-storage.service - Enable Persistent Storage in systemd-networkd.
Oct 19 14:33:09.671000 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'
Oct 19 14:33:09.710065 kernel: hv_vmbus: registering driver hyperv_drm
Oct 19 14:33:09.710127 kernel: hyperv_drm 5620e0c7-8062-4dce-aeb7-520c7ef76171: [drm] Synthvid Version major 3, minor 5
Oct 19 14:33:09.714096 kernel: Console: switching to colour dummy device 80x25
Oct 19 14:33:09.721115 kernel: [drm] Initialized hyperv_drm 1.0.0 for 5620e0c7-8062-4dce-aeb7-520c7ef76171 on minor 0
Oct 19 14:33:09.725103 kernel: Console: switching to colour frame buffer device 128x48
Oct 19 14:33:09.733103 kernel: hyperv_drm 5620e0c7-8062-4dce-aeb7-520c7ef76171: [drm] fb0: hyperv_drmdrmfb frame buffer device
Oct 19 14:33:09.763823 systemd[1]: Condition check resulted in dev-ptp_hyperv.device - /dev/ptp_hyperv being skipped.
Oct 19 14:33:09.837379 kernel: kvm_intel: Using Hyper-V Enlightened VMCS
Oct 19 14:33:09.837112 systemd[1]: Starting systemd-vconsole-setup.service - Virtual Console Setup...
Oct 19 14:33:09.843092 kernel: cpu_based_exec_ctrl unsupported with eVMCS: 0x20000
Oct 19 14:33:09.843143 kernel: vmentry_ctrl unsupported with eVMCS: 0x100000
Oct 19 14:33:09.843161 kernel: vmexit_ctrl unsupported with eVMCS: 0x10000000
Oct 19 14:33:09.846498 systemd[1]: systemd-vconsole-setup.service: Deactivated successfully.
Oct 19 14:33:09.847663 systemd[1]: Stopped systemd-vconsole-setup.service - Virtual Console Setup.
Oct 19 14:33:09.851000 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'
Oct 19 14:33:09.851000 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'
Oct 19 14:33:09.854482 systemd[1]: Starting systemd-vconsole-setup.service - Virtual Console Setup...
Oct 19 14:33:10.041240 systemd[1]: systemd-vconsole-setup.service: Deactivated successfully.
Oct 19 14:33:10.041491 systemd[1]: Stopped systemd-vconsole-setup.service - Virtual Console Setup.
Oct 19 14:33:10.042000 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'
Oct 19 14:33:10.042000 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'
Oct 19 14:33:10.050315 systemd[1]: Starting systemd-vconsole-setup.service - Virtual Console Setup...
Oct 19 14:33:10.332159 kernel: erofs (device dm-5): mounted with root inode @ nid 40.
Oct 19 14:33:10.355106 kernel: loop6: detected capacity change from 0 to 44505
Oct 19 14:33:10.360162 kernel:  loop6: p1 p2 p3
Oct 19 14:33:10.370117 kernel: device-mapper: verity: sha256 using "sha256-lib"
Oct 19 14:33:10.367823 systemd[1]: Found device dev-disk-by\x2dlabel-OEM.device - MSFT NVMe Accelerator v1.0 OEM.
Oct 19 14:33:10.370246 kernel: device-mapper: verity: Unrecognized verity feature request: root_hash_sig_key_desc
Oct 19 14:33:10.372250 kernel: device-mapper: table: 254:5: verity: Unrecognized verity feature request (-EINVAL)
Oct 19 14:33:10.372296 kernel: device-mapper: ioctl: error adding target to table
Oct 19 14:33:10.372354 (sd-merge)[2118]: device-mapper: reload ioctl on loop6p1-63-verity (254:5) failed: Invalid argument
Oct 19 14:33:10.375274 kernel: device-mapper: verity: sha256 using "sha256-lib"
Oct 19 14:33:10.384930 systemd[1]: Starting systemd-fsck@dev-disk-by\x2dlabel-OEM.service - File System Check on /dev/disk/by-label/OEM...
Oct 19 14:33:10.404130 kernel: erofs (device dm-5): mounted with root inode @ nid 40.
Oct 19 14:33:10.404495 (sd-merge)[2118]: Skipping extension refresh because no change was found, use --always-refresh=yes to always do a refresh.
Oct 19 14:33:10.406271 systemd[1]: Finished systemd-confext.service - Merge System Configuration Images into /etc/.
Oct 19 14:33:10.406000 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'
Oct 19 14:33:10.410359 systemd[1]: Starting systemd-sysext.service - Merge System Extension Images into /usr/ and /opt/...
Oct 19 14:33:10.424114 kernel: loop6: detected capacity change from 0 to 135824
Oct 19 14:33:10.429335 kernel:  loop6: p1 p2 p3
Oct 19 14:33:10.436116 kernel: device-mapper: verity: sha256 using "sha256-lib"
Oct 19 14:33:10.438903 systemd-sysext[2128]: device-mapper: reload ioctl on loop6p1-67-verity (254:5) failed: Invalid argument
Oct 19 14:33:10.440612 kernel: device-mapper: verity: Unrecognized verity feature request: root_hash_sig_key_desc
Oct 19 14:33:10.440991 kernel: device-mapper: table: 254:5: verity: Unrecognized verity feature request (-EINVAL)
Oct 19 14:33:10.441011 kernel: device-mapper: ioctl: error adding target to table
Oct 19 14:33:10.444048 kernel: device-mapper: verity: sha256 using "sha256-lib"
Oct 19 14:33:10.465836 systemd[1]: Finished systemd-fsck@dev-disk-by\x2dlabel-OEM.service - File System Check on /dev/disk/by-label/OEM.
Oct 19 14:33:10.467000 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'
Oct 19 14:33:10.472097 kernel: erofs (device dm-5): mounted with root inode @ nid 39.
Oct 19 14:33:10.497106 kernel: loop6: detected capacity change from 0 to 431832
Oct 19 14:33:10.508270 kernel:  loop6: p1 p2 p3
Oct 19 14:33:10.514161 kernel: device-mapper: verity: sha256 using "sha256-lib"
Oct 19 14:33:10.514212 kernel: device-mapper: verity: Unrecognized verity feature request: root_hash_sig_key_desc
Oct 19 14:33:10.515970 kernel: device-mapper: table: 254:5: verity: Unrecognized verity feature request (-EINVAL)
Oct 19 14:33:10.518799 kernel: device-mapper: ioctl: error adding target to table
Oct 19 14:33:10.518718 systemd-sysext[2128]: device-mapper: reload ioctl on loop6p1-72-verity (254:5) failed: Invalid argument
Oct 19 14:33:10.521108 kernel: device-mapper: verity: sha256 using "sha256-lib"
Oct 19 14:33:10.560112 kernel: erofs (device dm-5): mounted with root inode @ nid 39.
Oct 19 14:33:10.579105 kernel: loop6: detected capacity change from 0 to 169080
Oct 19 14:33:10.588181 kernel:  loop6: p1 p2 p3
Oct 19 14:33:10.593711 kernel: device-mapper: verity: sha256 using "sha256-lib"
Oct 19 14:33:10.593760 kernel: device-mapper: verity: Unrecognized verity feature request: root_hash_sig_key_desc
Oct 19 14:33:10.596123 kernel: device-mapper: table: 254:5: verity: Unrecognized verity feature request (-EINVAL)
Oct 19 14:33:10.598006 systemd-sysext[2128]: device-mapper: reload ioctl on loop6p1-77-verity (254:5) failed: Invalid argument
Oct 19 14:33:10.598217 kernel: device-mapper: ioctl: error adding target to table
Oct 19 14:33:10.600175 kernel: device-mapper: verity: sha256 using "sha256-lib"
Oct 19 14:33:10.624386 kernel: erofs (device dm-5): mounted with root inode @ nid 39.
Oct 19 14:33:10.641103 kernel: loop6: detected capacity change from 0 to 156464
Oct 19 14:33:10.668565 systemd-vconsole-setup[2108]: Configuration of first virtual console was skipped, ignoring remaining ones.
Oct 19 14:33:10.669130 systemd[1]: Finished systemd-vconsole-setup.service - Virtual Console Setup.
Oct 19 14:33:10.671000 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'
Oct 19 14:33:10.695219 kernel: loop6: detected capacity change from 0 to 135824
Oct 19 14:33:10.700279 kernel:  loop6: p1 p2 p3
Oct 19 14:33:10.705928 kernel: device-mapper: verity: sha256 using "sha256-lib"
Oct 19 14:33:10.705978 kernel: device-mapper: verity: Unrecognized verity feature request: root_hash_sig_key_desc
Oct 19 14:33:10.708417 kernel: device-mapper: table: 254:5: verity: Unrecognized verity feature request (-EINVAL)
Oct 19 14:33:10.710236 kernel: device-mapper: ioctl: error adding target to table
Oct 19 14:33:10.710330 (sd-merge)[2156]: device-mapper: reload ioctl on loop6p1-85-verity (254:5) failed: Invalid argument
Oct 19 14:33:10.713236 kernel: device-mapper: verity: sha256 using "sha256-lib"
Oct 19 14:33:10.743125 kernel: erofs (device dm-5): mounted with root inode @ nid 39.
Oct 19 14:33:10.745357 kernel: loop7: detected capacity change from 0 to 431832
Oct 19 14:33:10.754102 kernel:  loop7: p1 p2 p3
Oct 19 14:33:10.758601 kernel: device-mapper: verity: sha256 using "sha256-lib"
Oct 19 14:33:10.758656 kernel: device-mapper: verity: Unrecognized verity feature request: root_hash_sig_key_desc
Oct 19 14:33:10.759863 kernel: device-mapper: table: 254:6: verity: Unrecognized verity feature request (-EINVAL)
Oct 19 14:33:10.760581 kernel: device-mapper: ioctl: error adding target to table
Oct 19 14:33:10.760968 (sd-merge)[2156]: device-mapper: reload ioctl on loop7p1-89-verity (254:6) failed: Invalid argument
Oct 19 14:33:10.763667 kernel: device-mapper: verity: sha256 using "sha256-lib"
Oct 19 14:33:10.800425 kernel: erofs (device dm-6): mounted with root inode @ nid 39.
Oct 19 14:33:10.803103 kernel: loop8: detected capacity change from 0 to 169080
Oct 19 14:33:10.807120 kernel:  loop8: p1 p2 p3
Oct 19 14:33:10.816839 kernel: device-mapper: verity: sha256 using "sha256-lib"
Oct 19 14:33:10.816889 kernel: device-mapper: verity: Unrecognized verity feature request: root_hash_sig_key_desc
Oct 19 14:33:10.819647 kernel: device-mapper: table: 254:7: verity: Unrecognized verity feature request (-EINVAL)
Oct 19 14:33:10.821924 kernel: device-mapper: ioctl: error adding target to table
Oct 19 14:33:10.821999 (sd-merge)[2156]: device-mapper: reload ioctl on loop8p1-93-verity (254:7) failed: Invalid argument
Oct 19 14:33:10.826583 kernel: device-mapper: verity: sha256 using "sha256-lib"
Oct 19 14:33:10.851128 kernel: erofs (device dm-7): mounted with root inode @ nid 39.
Oct 19 14:33:10.855101 kernel: loop9: detected capacity change from 0 to 156464
Oct 19 14:33:10.870000 (sd-merge)[2156]: Skipping extension refresh because no change was found, use --always-refresh=yes to always do a refresh.
Oct 19 14:33:10.873943 systemd[1]: Finished systemd-sysext.service - Merge System Extension Images into /usr/ and /opt/.
Oct 19 14:33:10.876000 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'
Oct 19 14:33:10.878749 systemd[1]: Starting systemd-tmpfiles-setup.service - Create System Files and Directories...
Oct 19 14:33:10.901826 systemd-tmpfiles[2179]: /usr/lib/tmpfiles.d/nfs-utils.conf:6: Duplicate line for path "/var/lib/nfs/sm", ignoring.
Oct 19 14:33:10.901850 systemd-tmpfiles[2179]: /usr/lib/tmpfiles.d/nfs-utils.conf:7: Duplicate line for path "/var/lib/nfs/sm.bak", ignoring.
Oct 19 14:33:10.902057 systemd-tmpfiles[2179]: /usr/lib/tmpfiles.d/provision.conf:20: Duplicate line for path "/root", ignoring.
Oct 19 14:33:10.903215 systemd-tmpfiles[2179]: ACLs are not supported, ignoring.
Oct 19 14:33:10.903267 systemd-tmpfiles[2179]: ACLs are not supported, ignoring.
Oct 19 14:33:10.922546 systemd-tmpfiles[2179]: Detected autofs mount point '/boot' during canonicalization of 'boot'.
Oct 19 14:33:10.922556 systemd-tmpfiles[2179]: Skipping /boot
Oct 19 14:33:10.926542 systemd-tmpfiles[2179]: Detected autofs mount point '/boot' during canonicalization of 'boot'.
Oct 19 14:33:10.926605 systemd-tmpfiles[2179]: Skipping /boot
Oct 19 14:33:10.932955 systemd[1]: Finished systemd-tmpfiles-setup.service - Create System Files and Directories.
Oct 19 14:33:10.933000 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'
Oct 19 14:33:10.936768 systemd[1]: Starting audit-rules.service - Load Audit Rules...
Oct 19 14:33:10.941130 systemd[1]: Starting clean-ca-certificates.service - Clean up broken links in /etc/ssl/certs...
Oct 19 14:33:10.945633 systemd[1]: Starting ldconfig.service - Rebuild Dynamic Linker Cache...
Oct 19 14:33:10.949498 systemd[1]: Starting systemd-journal-catalog-update.service - Rebuild Journal Catalog...
Oct 19 14:33:10.954244 systemd[1]: Starting systemd-update-utmp.service - Record System Boot/Shutdown in UTMP...
Oct 19 14:33:10.974000 audit[2186]: AUDIT1127 pid=2186 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'
Oct 19 14:33:10.978167 systemd[1]: Finished systemd-update-utmp.service - Record System Boot/Shutdown in UTMP.
Oct 19 14:33:10.978000 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'
Oct 19 14:33:11.128594 systemd[1]: Finished systemd-journal-catalog-update.service - Rebuild Journal Catalog.
Oct 19 14:33:11.130000 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'
Oct 19 14:33:11.565203 systemd-networkd[2031]: eth0: Gained IPv6LL
Oct 19 14:33:11.567332 systemd[1]: Finished systemd-networkd-wait-online.service - Wait for Network to be Online.
Oct 19 14:33:11.569000 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'
Oct 19 14:33:11.573184 kernel: kauditd_printk_skb: 79 callbacks suppressed
Oct 19 14:33:11.570718 systemd[1]: Reached target network-online.target - Network is Online.
Oct 19 14:33:11.573285 kernel: audit: type=1130 audit(1792420391.569:169): 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'
Oct 19 14:33:11.693910 augenrules[2213]: No rules
Oct 19 14:33:11.692000 audit: CONFIG_CHANGE auid=4294967295 ses=4294967295 subj=system_u:system_r:kernel_t:s0 op=add_rule key=(null) list=5 res=1
Oct 19 14:33:11.692000 audit[2213]: SYSCALL arch=c000003e syscall=44 success=yes exit=1056 a0=3 a1=7ffde5a5ca90 a2=420 a3=0 items=0 ppid=2182 pid=2213 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)
Oct 19 14:33:11.692000 audit: PROCTITLE proctitle=2F7362696E2F617564697463746C002D52002F6574632F61756469742F61756469742E72756C6573
Oct 19 14:33:11.695380 systemd[1]: audit-rules.service: Deactivated successfully.
Oct 19 14:33:11.701856 kernel: audit: type=1305 audit(1792420391.692:170): auid=4294967295 ses=4294967295 subj=system_u:system_r:kernel_t:s0 op=add_rule key=(null) list=5 res=1
Oct 19 14:33:11.695666 systemd[1]: Finished audit-rules.service - Load Audit Rules.
Oct 19 14:33:11.701904 kernel: audit: type=1300 audit(1792420391.692:170): arch=c000003e syscall=44 success=yes exit=1056 a0=3 a1=7ffde5a5ca90 a2=420 a3=0 items=0 ppid=2182 pid=2213 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)
Oct 19 14:33:11.701919 kernel: audit: type=1327 audit(1792420391.692:170): proctitle=2F7362696E2F617564697463746C002D52002F6574632F61756469742F61756469742E72756C6573
Oct 19 14:33:11.745270 systemd[1]: Finished clean-ca-certificates.service - Clean up broken links in /etc/ssl/certs.
Oct 19 14:33:11.746847 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
Oct 19 14:33:17.901667 ldconfig[2184]: ldconfig: /usr/lib/ld.so.conf is not an ELF file - it has the wrong magic bytes at the start.
Oct 19 14:33:17.912920 systemd[1]: Finished ldconfig.service - Rebuild Dynamic Linker Cache.
Oct 19 14:33:17.917290 systemd[1]: Starting systemd-update-done.service - Update is Completed...
Oct 19 14:33:17.932896 systemd[1]: Finished systemd-update-done.service - Update is Completed.
Oct 19 14:33:17.934646 systemd[1]: Reached target sysinit.target - System Initialization.
Oct 19 14:33:17.937225 systemd[1]: Started motdgen.path - Watch for update engine configuration changes.
Oct 19 14:33:17.938966 systemd[1]: Started user-cloudinit@var-lib-flatcar\x2dinstall-user_data.path - Watch for a cloud-config at /var/lib/flatcar-install/user_data.
Oct 19 14:33:17.942150 systemd[1]: Started google-oslogin-cache.timer - NSS cache refresh timer.
Oct 19 14:33:17.943910 systemd[1]: Started logrotate.timer - Daily rotation of log files.
Oct 19 14:33:17.947207 systemd[1]: Started mdadm.timer - Weekly check for MD array's redundancy information..
Oct 19 14:33:17.950148 systemd[1]: Started systemd-sysupdate-reboot.timer - Reboot Automatically After System Update.
Oct 19 14:33:17.953194 systemd[1]: Started systemd-sysupdate.timer - Automatic System Update.
Oct 19 14:33:17.956126 systemd[1]: Started systemd-tmpfiles-clean.timer - Daily Cleanup of Temporary Directories.
Oct 19 14:33:17.959130 systemd[1]: update-engine-stub.timer - Update Engine Stub Timer skipped, unmet condition check ConditionPathExists=/usr/.noupdate
Oct 19 14:33:17.959168 systemd[1]: Reached target paths.target - Path Units.
Oct 19 14:33:17.962123 systemd[1]: Reached target timers.target - Timer Units.
Oct 19 14:33:17.964158 systemd[1]: Listening on dbus.socket - D-Bus System Message Bus Socket.
Oct 19 14:33:17.966461 systemd[1]: Starting docker.socket - Docker Socket for the API...
Oct 19 14:33:17.969670 systemd[1]: Listening on sshd-unix-local.socket - OpenSSH Server Socket (systemd-ssh-generator, AF_UNIX Local).
Oct 19 14:33:17.972895 systemd[1]: Listening on sshd.socket - OpenSSH Server Socket.
Oct 19 14:33:17.976672 systemd[1]: Listening on systemd-logind-varlink.socket - User Login Management Varlink Socket.
Oct 19 14:33:17.978689 systemd[1]: Listening on systemd-machined.socket - Virtual Machine and Container Registration Service Socket.
Oct 19 14:33:17.980769 systemd[1]: Listening on docker.socket - Docker Socket for the API.
Oct 19 14:33:17.985898 systemd[1]: Reached target sockets.target - Socket Units.
Oct 19 14:33:17.989138 systemd[1]: Reached target basic.target - Basic System.
Oct 19 14:33:17.991186 systemd[1]: addon-config@oem.service - Configure Addon /oem skipped, no trigger condition checks were met.
Oct 19 14:33:17.991214 systemd[1]: addon-run@oem.service - Run Addon /oem skipped, no trigger condition checks were met.
Oct 19 14:33:17.992723 systemd[1]: Starting chronyd.service - NTP client/server...
Oct 19 14:33:17.995934 systemd[1]: Starting containerd.service - containerd container runtime...
Oct 19 14:33:18.000661 systemd[1]: Starting dbus.service - D-Bus System Message Bus...
Oct 19 14:33:18.003216 systemd[1]: Finished dracut-shutdown.service - Restore /run/initramfs on shutdown.
Oct 19 14:33:18.007880 systemd[1]: Starting enable-oem-cloudinit.service - Enable cloudinit...
Oct 19 14:33:18.014168 systemd[1]: Starting extend-filesystems.service - Extend Filesystems...
Oct 19 14:33:18.017183 systemd[1]: flatcar-setup-environment.service - Modifies /etc/environment for CoreOS skipped, unmet condition check ConditionPathExists=/oem/bin/flatcar-setup-environment
Oct 19 14:33:18.019163 systemd[1]: Starting google-oslogin-cache.service - NSS cache refresh...
Oct 19 14:33:18.022153 systemd[1]: hv_fcopy_uio_daemon.service - Hyper-V FCOPY UIO daemon skipped, unmet condition check ConditionPathExists=/sys/bus/vmbus/devices/eb765408-105f-49b6-b4aa-c123b64d17d4/uio
Oct 19 14:33:18.023266 systemd[1]: Started hv_kvp_daemon.service - Hyper-V KVP daemon.
Oct 19 14:33:18.025258 systemd[1]: hv_vss_daemon.service - Hyper-V VSS daemon skipped, unmet condition check ConditionPathExists=/dev/vmbus/hv_vss
Oct 19 14:33:18.028748 systemd[1]: Starting motdgen.service - Generate /run/flatcar/motd...
Oct 19 14:33:18.034821 systemd[1]: Starting nvidia.service - NVIDIA Configure Service...
Oct 19 14:33:18.039222 systemd[1]: Starting ssh-key-proc-cmdline.service - Install an ssh key from /proc/cmdline...
Oct 19 14:33:18.045169 systemd[1]: Starting sshd-keygen.service - Generate sshd host keys...
Oct 19 14:33:18.052322 systemd[1]: Starting systemd-logind.service - User Login Management...
Oct 19 14:33:18.053967 systemd[1]: tcsd.service - TCG Core Services Daemon skipped, unmet condition check ConditionPathExists=/dev/tpm0
Oct 19 14:33:18.055374 jq[2229]: false
Oct 19 14:33:18.057107 KVP[2232]: KVP starting; pid is:2232
Oct 19 14:33:18.058344 systemd[1]: Starting update-engine.service - Update Engine...
Oct 19 14:33:18.063548 systemd[1]: Starting update-ssh-keys-after-ignition.service - Run update-ssh-keys once after Ignition...
Oct 19 14:33:18.074014 KVP[2232]: KVP LIC Version: 3.1
Oct 19 14:33:18.074193 kernel: hv_utils: KVP IC version 4.0
Oct 19 14:33:18.074587 systemd[1]: enable-oem-cloudinit.service: Skipped due to 'exec-condition'.
Oct 19 14:33:18.074805 systemd[1]: Condition check resulted in enable-oem-cloudinit.service - Enable cloudinit being skipped.
Oct 19 14:33:18.077591 systemd[1]: ssh-key-proc-cmdline.service: Deactivated successfully.
Oct 19 14:33:18.077829 systemd[1]: Finished ssh-key-proc-cmdline.service - Install an ssh key from /proc/cmdline.
Oct 19 14:33:18.084128 jq[2243]: true
Oct 19 14:33:18.090852 extend-filesystems[2230]: Found /dev/nvme0n1p6
Oct 19 14:33:18.093073 motdgen[2257]: /oem/oem-release: line 2: Azure: command not found
Oct 19 14:33:18.105107 google_oslogin_nss_cache[2231]: oslogin_cache_refresh[2231]: Refreshing passwd entry cache
Oct 19 14:33:18.103439 oslogin_cache_refresh[2231]: Refreshing passwd entry cache
Oct 19 14:33:18.116022 extend-filesystems[2230]: Found /dev/nvme0n1p9
Oct 19 14:33:18.118688 extend-filesystems[2230]: Checking size of /dev/nvme0n1p9
Oct 19 14:33:18.124483 systemd[1]: motdgen.service: Deactivated successfully.
Oct 19 14:33:18.125134 systemd[1]: Finished motdgen.service - Generate /run/flatcar/motd.
Oct 19 14:33:18.126139 google_oslogin_nss_cache[2231]: oslogin_cache_refresh[2231]: Failure getting users, quitting
Oct 19 14:33:18.126139 google_oslogin_nss_cache[2231]: oslogin_cache_refresh[2231]: Produced empty passwd cache file, removing /etc/oslogin_passwd.cache.bak.
Oct 19 14:33:18.126139 google_oslogin_nss_cache[2231]: oslogin_cache_refresh[2231]: Refreshing group entry cache
Oct 19 14:33:18.125951 oslogin_cache_refresh[2231]: Failure getting users, quitting
Oct 19 14:33:18.125968 oslogin_cache_refresh[2231]: Produced empty passwd cache file, removing /etc/oslogin_passwd.cache.bak.
Oct 19 14:33:18.126003 oslogin_cache_refresh[2231]: Refreshing group entry cache
Oct 19 14:33:18.128702 jq[2250]: true
Oct 19 14:33:18.140535 google_oslogin_nss_cache[2231]: oslogin_cache_refresh[2231]: Failure getting groups, quitting
Oct 19 14:33:18.140535 google_oslogin_nss_cache[2231]: oslogin_cache_refresh[2231]: Produced empty group cache file, removing /etc/oslogin_group.cache.bak.
Oct 19 14:33:18.140531 oslogin_cache_refresh[2231]: Failure getting groups, quitting
Oct 19 14:33:18.140540 oslogin_cache_refresh[2231]: Produced empty group cache file, removing /etc/oslogin_group.cache.bak.
Oct 19 14:33:18.142268 systemd[1]: google-oslogin-cache.service: Deactivated successfully.
Oct 19 14:33:18.142506 systemd[1]: Finished google-oslogin-cache.service - NSS cache refresh.
Oct 19 14:33:18.164913 systemd[1]: Finished nvidia.service - NVIDIA Configure Service.
Oct 19 14:33:18.171247 chronyd[2226]: chronyd version 4.8 starting (+CMDMON +REFCLOCK +RTC +PRIVDROP +SCFILTER -SIGND +NTS +SECHASH +IPV6 -DEBUG)
Oct 19 14:33:18.175180 extend-filesystems[2230]: Resized partition /dev/nvme0n1p9
Oct 19 14:33:18.183708 update_engine[2242]: I20261019 14:33:18.183640  2242 main.cc:92] Flatcar Update Engine starting
Oct 19 14:33:18.207060 extend-filesystems[2301]: resize2fs 1.47.4 (6-Mar-2025)
Oct 19 14:33:18.205422 systemd[1]: Started chronyd.service - NTP client/server.
Oct 19 14:33:18.205162 chronyd[2226]: Timezone right/UTC failed leap second check, ignoring
Oct 19 14:33:18.205854 systemd-logind[2241]: New seat seat0.
Oct 19 14:33:18.205289 chronyd[2226]: Loaded seccomp filter (level 2)
Oct 19 14:33:18.213775 systemd-logind[2241]: Watching system buttons on /dev/input/event1 (AT Translated Set 2 keyboard)
Oct 19 14:33:18.214034 systemd[1]: Started systemd-logind.service - User Login Management.
Oct 19 14:33:18.345640 sshd_keygen[2278]: ssh-keygen: generating new host keys: RSA ECDSA ED25519 MLDSA44-ED25519
Oct 19 14:33:18.366940 systemd[1]: Finished sshd-keygen.service - Generate sshd host keys.
Oct 19 14:33:18.371110 systemd[1]: Starting issuegen.service - Generate /run/issue...
Oct 19 14:33:18.374032 systemd[1]: Starting waagent.service - Microsoft Azure Linux Agent...
Oct 19 14:33:18.381101 kernel: EXT4-fs (nvme0n1p9): resizing filesystem from 6359552 to 6376955 blocks
Oct 19 14:33:18.385105 kernel: EXT4-fs (nvme0n1p9): resized filesystem to 6376955
Oct 19 14:33:18.389725 systemd[1]: issuegen.service: Deactivated successfully.
Oct 19 14:33:18.813846 update_engine[2242]: I20261019 14:33:18.724694  2242 update_check_scheduler.cc:74] Next update check in 2m15s
Oct 19 14:33:18.389937 systemd[1]: Finished issuegen.service - Generate /run/issue.
Oct 19 14:33:18.721276 dbus-daemon[2228]: [system] SELinux support is enabled
Oct 19 14:33:18.392073 systemd[1]: Starting systemd-user-sessions.service - Permit User Sessions...
Oct 19 14:33:18.769714 dbus-daemon[2228]: [system] Successfully activated service 'org.freedesktop.systemd1'
Oct 19 14:33:18.432073 systemd[1]: Finished systemd-user-sessions.service - Permit User Sessions.
Oct 19 14:33:18.434584 systemd[1]: Started getty@tty1.service - Getty on tty1.
Oct 19 14:33:18.437731 systemd[1]: Started serial-getty@ttyS0.service - Serial Getty on ttyS0.
Oct 19 14:33:18.440305 systemd[1]: Reached target getty.target - Login Prompts.
Oct 19 14:33:18.721460 systemd[1]: Started dbus.service - D-Bus System Message Bus.
Oct 19 14:33:18.762831 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
Oct 19 14:33:18.762860 systemd[1]: Reached target system-config.target - Load system-provided cloud configs.
Oct 19 14:33:18.764346 systemd[1]: user-cloudinit-proc-cmdline.service - Load cloud-config from url defined in /proc/cmdline skipped, unmet condition check ConditionKernelCommandLine=cloud-config-url
Oct 19 14:33:18.764359 systemd[1]: Reached target user-config.target - Load user-provided cloud configs.
Oct 19 14:33:18.768371 systemd[1]: Started update-engine.service - Update Engine.
Oct 19 14:33:18.772715 systemd[1]: Started locksmithd.service - Cluster reboot manager.
Oct 19 14:33:18.820072 bash[2296]: Updated "/home/core/.ssh/authorized_keys"
Oct 19 14:33:18.822386 systemd[1]: Finished update-ssh-keys-after-ignition.service - Run update-ssh-keys once after Ignition.
Oct 19 14:33:18.825781 systemd[1]: sshkeys.service skipped, no trigger condition checks were met.
Oct 19 14:33:18.831242 systemd[1]: Started waagent.service - Microsoft Azure Linux Agent.
Oct 19 14:33:18.899993 extend-filesystems[2301]: Filesystem at /dev/nvme0n1p9 is mounted on /; on-line resizing required
Oct 19 14:33:18.899993 extend-filesystems[2301]: old_desc_blocks = 4, new_desc_blocks = 4
Oct 19 14:33:18.899993 extend-filesystems[2301]: The filesystem on /dev/nvme0n1p9 is now 6376955 (4k) blocks long.
Oct 19 14:33:18.910152 extend-filesystems[2230]: Resized filesystem in /dev/nvme0n1p9
Oct 19 14:33:18.901999 systemd[1]: extend-filesystems.service: Deactivated successfully.
Oct 19 14:33:18.902206 systemd[1]: Finished extend-filesystems.service - Extend Filesystems.
Oct 19 14:33:19.306314 locksmithd[2345]: locksmithd starting currentOperation="UPDATE_STATUS_IDLE" strategy="reboot"
Oct 19 14:33:21.299374 containerd[2268]: time="2026-10-19T14:33:21Z" 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
Oct 19 14:33:21.300266 containerd[2268]: time="2026-10-19T14:33:21Z" level=warning msg="Configuration migrated from version 2, use `containerd config migrate` to avoid migration" t="17.359µs"
Oct 19 14:33:21.301816 containerd[2268]: time="2026-10-19T14:33:21.301772330Z" level=info msg="starting containerd" revision=1294c24a7da8e5a793ed378161673abe94118892 version=v2.3.5
Oct 19 14:33:21.302155 containerd[2268]: time="2026-10-19T14:33:21.302126681Z" level=info msg="loading plugin" id=io.containerd.content.v1.content type=io.containerd.content.v1
Oct 19 14:33:21.302399 containerd[2268]: time="2026-10-19T14:33:21.302378072Z" level=warning msg="failed check for fsverity support" error="enable fsverity failed: operation not supported" path=/var/lib/containerd/io.containerd.content.v1.content
Oct 19 14:33:21.302450 containerd[2268]: time="2026-10-19T14:33:21.302408783Z" level=info msg="loading plugin" id=io.containerd.image-verifier.v1.bindir type=io.containerd.image-verifier.v1
Oct 19 14:33:21.302450 containerd[2268]: time="2026-10-19T14:33:21.302423337Z" level=info msg="loading plugin" id=io.containerd.internal.v1.opt type=io.containerd.internal.v1
Oct 19 14:33:21.302532 containerd[2268]: time="2026-10-19T14:33:21.302519624Z" level=info msg="loading plugin" id=io.containerd.warning.v1.deprecations type=io.containerd.warning.v1
Oct 19 14:33:21.302555 containerd[2268]: time="2026-10-19T14:33:21.302533192Z" level=info msg="loading plugin" id=io.containerd.event.v1.exchange type=io.containerd.event.v1
Oct 19 14:33:21.302823 containerd[2268]: time="2026-10-19T14:33:21.302809942Z" level=info msg="loading plugin" id=io.containerd.mount-handler.v1.erofs type=io.containerd.mount-handler.v1
Oct 19 14:33:21.302855 containerd[2268]: time="2026-10-19T14:33:21.302827038Z" level=info msg="loading plugin" id=io.containerd.snapshotter.v1.blockfile type=io.containerd.snapshotter.v1
Oct 19 14:33:21.302908 containerd[2268]: time="2026-10-19T14:33:21.302884348Z" level=info msg="skip loading plugin" error="no scratch file generator: skip plugin" id=io.containerd.snapshotter.v1.blockfile type=io.containerd.snapshotter.v1
Oct 19 14:33:21.302908 containerd[2268]: time="2026-10-19T14:33:21.302896171Z" level=info msg="loading plugin" id=io.containerd.snapshotter.v1.btrfs type=io.containerd.snapshotter.v1
Oct 19 14:33:21.303175 containerd[2268]: time="2026-10-19T14:33:21.303156374Z" 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
Oct 19 14:33:21.303175 containerd[2268]: time="2026-10-19T14:33:21.303172366Z" level=info msg="loading plugin" id=io.containerd.snapshotter.v1.devmapper type=io.containerd.snapshotter.v1
Oct 19 14:33:21.303230 containerd[2268]: time="2026-10-19T14:33:21.303183502Z" level=info msg="skip loading plugin" error="devmapper not configured: skip plugin" id=io.containerd.snapshotter.v1.devmapper type=io.containerd.snapshotter.v1
Oct 19 14:33:21.303230 containerd[2268]: time="2026-10-19T14:33:21.303193816Z" level=info msg="loading plugin" id=io.containerd.snapshotter.v1.erofs type=io.containerd.snapshotter.v1
Oct 19 14:33:21.303448 containerd[2268]: time="2026-10-19T14:33:21.303432685Z" level=info msg="loading plugin" id=io.containerd.snapshotter.v1.native type=io.containerd.snapshotter.v1
Oct 19 14:33:21.303512 containerd[2268]: time="2026-10-19T14:33:21.303500039Z" level=info msg="loading plugin" id=io.containerd.snapshotter.v1.overlayfs type=io.containerd.snapshotter.v1
Oct 19 14:33:21.303633 containerd[2268]: time="2026-10-19T14:33:21.303619403Z" level=info msg="loading plugin" id=io.containerd.snapshotter.v1.zfs type=io.containerd.snapshotter.v1
Oct 19 14:33:21.303657 containerd[2268]: time="2026-10-19T14:33:21.303646794Z" 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
Oct 19 14:33:21.303681 containerd[2268]: time="2026-10-19T14:33:21.303656596Z" level=info msg="loading plugin" id=io.containerd.monitor.task.v1.cgroups type=io.containerd.monitor.task.v1
Oct 19 14:33:21.304065 containerd[2268]: time="2026-10-19T14:33:21.304045379Z" level=info msg="loading plugin" id=io.containerd.metadata.v1.bolt type=io.containerd.metadata.v1
Oct 19 14:33:21.304128 containerd[2268]: time="2026-10-19T14:33:21.304113198Z" level=info msg="metadata content store policy set" policy=shared
Oct 19 14:33:21.322865 containerd[2268]: time="2026-10-19T14:33:21.322834972Z" level=info msg="loading plugin" id=io.containerd.gc.v1.scheduler type=io.containerd.gc.v1
Oct 19 14:33:21.322961 containerd[2268]: time="2026-10-19T14:33:21.322886835Z" level=info msg="loading plugin" id=io.containerd.server.v1.metrics type=io.containerd.server.v1
Oct 19 14:33:21.322961 containerd[2268]: time="2026-10-19T14:33:21.322912147Z" level=info msg="skip loading plugin" error="skip plugin" id=io.containerd.server.v1.metrics type=io.containerd.server.v1
Oct 19 14:33:21.322961 containerd[2268]: time="2026-10-19T14:33:21.322921628Z" level=info msg="loading plugin" id=io.containerd.tracing.processor.v1.otlp type=io.containerd.tracing.processor.v1
Oct 19 14:33:21.322961 containerd[2268]: time="2026-10-19T14:33:21.322936807Z" 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
Oct 19 14:33:21.322961 containerd[2268]: time="2026-10-19T14:33:21.322946021Z" level=info msg="loading plugin" id=io.containerd.internal.v1.tracing type=io.containerd.internal.v1
Oct 19 14:33:21.322961 containerd[2268]: time="2026-10-19T14:33:21.322955408Z" level=info msg="skip loading plugin" error="skip plugin: tracing endpoint not configured" id=io.containerd.internal.v1.tracing type=io.containerd.internal.v1
Oct 19 14:33:21.323149 containerd[2268]: time="2026-10-19T14:33:21.322964098Z" level=info msg="loading plugin" id=io.containerd.nri.v1.nri type=io.containerd.nri.v1
Oct 19 14:33:21.323216 containerd[2268]: time="2026-10-19T14:33:21.323180723Z" level=info msg="built-in NRI default validator is disabled"
Oct 19 14:33:21.323216 containerd[2268]: time="2026-10-19T14:33:21.323207117Z" level=info msg="runtime interface created"
Oct 19 14:33:21.323216 containerd[2268]: time="2026-10-19T14:33:21.323212110Z" level=info msg="created NRI interface"
Oct 19 14:33:21.323297 containerd[2268]: time="2026-10-19T14:33:21.323219742Z" level=info msg="loading plugin" id=io.containerd.ttrpc.v1.otelttrpc type=io.containerd.ttrpc.v1
Oct 19 14:33:21.323297 containerd[2268]: time="2026-10-19T14:33:21.323229650Z" level=info msg="loading plugin" id=io.containerd.service.v1.containers-service type=io.containerd.service.v1
Oct 19 14:33:21.323297 containerd[2268]: time="2026-10-19T14:33:21.323251368Z" level=info msg="loading plugin" id=io.containerd.service.v1.content-service type=io.containerd.service.v1
Oct 19 14:33:21.323297 containerd[2268]: time="2026-10-19T14:33:21.323261358Z" level=info msg="loading plugin" id=io.containerd.differ.v1.erofs type=io.containerd.differ.v1
Oct 19 14:33:21.354543 containerd[2268]: time="2026-10-19T14:33:21.354513468Z" level=info msg="loading plugin" id=io.containerd.mount-manager.v1.bolt type=io.containerd.mount-manager.v1
Oct 19 14:33:21.354678 containerd[2268]: time="2026-10-19T14:33:21.354660130Z" level=info msg="loading plugin" id=io.containerd.differ.v1.walking type=io.containerd.differ.v1
Oct 19 14:33:21.354707 containerd[2268]: time="2026-10-19T14:33:21.354683238Z" level=info msg="loading plugin" id=io.containerd.service.v1.diff-service type=io.containerd.service.v1
Oct 19 14:33:21.354707 containerd[2268]: time="2026-10-19T14:33:21.354696842Z" level=info msg="loading plugin" id=io.containerd.service.v1.images-service type=io.containerd.service.v1
Oct 19 14:33:21.354748 containerd[2268]: time="2026-10-19T14:33:21.354708691Z" level=info msg="loading plugin" id=io.containerd.service.v1.introspection-service type=io.containerd.service.v1
Oct 19 14:33:21.354748 containerd[2268]: time="2026-10-19T14:33:21.354718233Z" level=info msg="loading plugin" id=io.containerd.service.v1.namespaces-service type=io.containerd.service.v1
Oct 19 14:33:21.354748 containerd[2268]: time="2026-10-19T14:33:21.354727471Z" level=info msg="loading plugin" id=io.containerd.service.v1.snapshots-service type=io.containerd.service.v1
Oct 19 14:33:21.354748 containerd[2268]: time="2026-10-19T14:33:21.354738390Z" level=info msg="loading plugin" id=io.containerd.shim.v1.manager type=io.containerd.shim.v1
Oct 19 14:33:21.354818 containerd[2268]: time="2026-10-19T14:33:21.354751013Z" level=info msg="loading plugin" id=io.containerd.runtime.v2.task type=io.containerd.runtime.v2
Oct 19 14:33:21.354839 containerd[2268]: time="2026-10-19T14:33:21.354832290Z" level=info msg="loading plugin" id=io.containerd.service.v1.tasks-service type=io.containerd.service.v1
Oct 19 14:33:21.354871 containerd[2268]: time="2026-10-19T14:33:21.354857232Z" level=info msg="loading plugin" id=io.containerd.grpc.v1.containers type=io.containerd.grpc.v1
Oct 19 14:33:21.354897 containerd[2268]: time="2026-10-19T14:33:21.354871394Z" level=info msg="loading plugin" id=io.containerd.grpc.v1.content type=io.containerd.grpc.v1
Oct 19 14:33:21.354897 containerd[2268]: time="2026-10-19T14:33:21.354880460Z" level=info msg="loading plugin" id=io.containerd.grpc.v1.diff type=io.containerd.grpc.v1
Oct 19 14:33:21.354897 containerd[2268]: time="2026-10-19T14:33:21.354889152Z" level=info msg="loading plugin" id=io.containerd.grpc.v1.events type=io.containerd.grpc.v1
Oct 19 14:33:21.354950 containerd[2268]: time="2026-10-19T14:33:21.354896971Z" level=info msg="loading plugin" id=io.containerd.grpc.v1.images type=io.containerd.grpc.v1
Oct 19 14:33:21.354950 containerd[2268]: time="2026-10-19T14:33:21.354910126Z" level=info msg="loading plugin" id=io.containerd.grpc.v1.introspection type=io.containerd.grpc.v1
Oct 19 14:33:21.354950 containerd[2268]: time="2026-10-19T14:33:21.354920107Z" level=info msg="loading plugin" id=io.containerd.lease.v1.manager type=io.containerd.lease.v1
Oct 19 14:33:21.354950 containerd[2268]: time="2026-10-19T14:33:21.354929499Z" level=info msg="loading plugin" id=io.containerd.grpc.v1.leases type=io.containerd.grpc.v1
Oct 19 14:33:21.354950 containerd[2268]: time="2026-10-19T14:33:21.354939425Z" level=info msg="loading plugin" id=io.containerd.grpc.v1.mounts type=io.containerd.grpc.v1
Oct 19 14:33:21.354950 containerd[2268]: time="2026-10-19T14:33:21.354946643Z" level=info msg="loading plugin" id=io.containerd.grpc.v1.namespaces type=io.containerd.grpc.v1
Oct 19 14:33:21.355057 containerd[2268]: time="2026-10-19T14:33:21.354956631Z" level=info msg="loading plugin" id=io.containerd.sandbox.store.v1.local type=io.containerd.sandbox.store.v1
Oct 19 14:33:21.355057 containerd[2268]: time="2026-10-19T14:33:21.354965229Z" level=info msg="loading plugin" id=io.containerd.transfer.v1.local type=io.containerd.transfer.v1
Oct 19 14:33:21.355057 containerd[2268]: time="2026-10-19T14:33:21.355003368Z" level=info msg="loading plugin" id=io.containerd.cri.v1.images type=io.containerd.cri.v1
Oct 19 14:33:21.356162 containerd[2268]: time="2026-10-19T14:33:21.355775401Z" level=info msg="Get image filesystem path \"/var/lib/containerd/io.containerd.snapshotter.v1.overlayfs\" for snapshotter \"overlayfs\""
Oct 19 14:33:21.356217 containerd[2268]: time="2026-10-19T14:33:21.356164296Z" level=info msg="Start snapshots syncer"
Oct 19 14:33:21.356217 containerd[2268]: time="2026-10-19T14:33:21.356182848Z" level=info msg="loading plugin" id=io.containerd.cri.v1.runtime type=io.containerd.cri.v1
Oct 19 14:33:21.356501 containerd[2268]: time="2026-10-19T14:33:21.356472997Z" 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\":\"\",\"enableCRIU\":true,\"enableExperimentalRestoreViaCreate\":false,\"containerdRootDir\":\"/var/lib/containerd\",\"containerdEndpoint\":\"/run/containerd/containerd.sock\",\"rootDir\":\"/var/lib/containerd/io.containerd.grpc.v1.cri\",\"stateDir\":\"/run/containerd/io.containerd.grpc.v1.cri\"}"
Oct 19 14:33:21.356616 containerd[2268]: time="2026-10-19T14:33:21.356515867Z" level=info msg="loading plugin" id=io.containerd.podsandbox.controller.v1.podsandbox type=io.containerd.podsandbox.controller.v1
Oct 19 14:33:21.356933 containerd[2268]: time="2026-10-19T14:33:21.356890396Z" level=info msg="loading plugin" id=io.containerd.sandbox.controller.v1.shim type=io.containerd.sandbox.controller.v1
Oct 19 14:33:21.357137 containerd[2268]: time="2026-10-19T14:33:21.357069970Z" level=info msg="loading plugin" id=io.containerd.grpc.v1.sandbox-controllers type=io.containerd.grpc.v1
Oct 19 14:33:21.357137 containerd[2268]: time="2026-10-19T14:33:21.357110798Z" level=info msg="loading plugin" id=io.containerd.grpc.v1.sandboxes type=io.containerd.grpc.v1
Oct 19 14:33:21.357137 containerd[2268]: time="2026-10-19T14:33:21.357121426Z" level=info msg="loading plugin" id=io.containerd.grpc.v1.snapshots type=io.containerd.grpc.v1
Oct 19 14:33:21.357137 containerd[2268]: time="2026-10-19T14:33:21.357132451Z" level=info msg="loading plugin" id=io.containerd.streaming.v1.manager type=io.containerd.streaming.v1
Oct 19 14:33:21.357233 containerd[2268]: time="2026-10-19T14:33:21.357144910Z" level=info msg="loading plugin" id=io.containerd.grpc.v1.streaming type=io.containerd.grpc.v1
Oct 19 14:33:21.357233 containerd[2268]: time="2026-10-19T14:33:21.357154861Z" level=info msg="loading plugin" id=io.containerd.grpc.v1.tasks type=io.containerd.grpc.v1
Oct 19 14:33:21.357233 containerd[2268]: time="2026-10-19T14:33:21.357164370Z" level=info msg="loading plugin" id=io.containerd.grpc.v1.transfer type=io.containerd.grpc.v1
Oct 19 14:33:21.357233 containerd[2268]: time="2026-10-19T14:33:21.357175810Z" level=info msg="loading plugin" id=io.containerd.grpc.v1.version type=io.containerd.grpc.v1
Oct 19 14:33:21.357233 containerd[2268]: time="2026-10-19T14:33:21.357183697Z" level=info msg="loading plugin" id=io.containerd.grpc.v1.healthcheck type=io.containerd.grpc.v1
Oct 19 14:33:21.357233 containerd[2268]: time="2026-10-19T14:33:21.357192857Z" level=info msg="loading plugin" id=io.containerd.grpc.v1.cri type=io.containerd.grpc.v1
Oct 19 14:33:21.357233 containerd[2268]: time="2026-10-19T14:33:21.357208937Z" level=info msg="Connect containerd service"
Oct 19 14:33:21.357360 containerd[2268]: time="2026-10-19T14:33:21.357233255Z" level=info msg="using experimental NRI integration - disable nri plugin to prevent this"
Oct 19 14:33:21.358485 containerd[2268]: time="2026-10-19T14:33:21.358459428Z" 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"
Oct 19 14:33:22.223419 containerd[2268]: time="2026-10-19T14:33:22.223370969Z" level=info msg="loading plugin" id=io.containerd.server.v1.ttrpc type=io.containerd.server.v1
Oct 19 14:33:22.223535 containerd[2268]: time="2026-10-19T14:33:22.223475400Z" level=info msg="loading plugin" id=io.containerd.monitor.container.v1.restart type=io.containerd.monitor.container.v1
Oct 19 14:33:22.223535 containerd[2268]: time="2026-10-19T14:33:22.223511605Z" level=info msg="loading plugin" id=io.containerd.metrics.v1.grpc-prometheus type=io.containerd.metrics.v1
Oct 19 14:33:22.223596 containerd[2268]: time="2026-10-19T14:33:22.223552983Z" level=info msg="loading plugin" id=io.containerd.metrics.v1.grpc-otel type=io.containerd.metrics.v1
Oct 19 14:33:22.223596 containerd[2268]: time="2026-10-19T14:33:22.223573767Z" level=info msg="loading plugin" id=io.containerd.server.v1.grpc type=io.containerd.server.v1
Oct 19 14:33:22.223892 containerd[2268]: time="2026-10-19T14:33:22.223699802Z" level=info msg="Start subscribing containerd event"
Oct 19 14:33:22.223892 containerd[2268]: time="2026-10-19T14:33:22.223760091Z" level=info msg="Start stats collector"
Oct 19 14:33:22.223892 containerd[2268]: time="2026-10-19T14:33:22.223767187Z" level=info msg="Start recovering state"
Oct 19 14:33:22.223892 containerd[2268]: time="2026-10-19T14:33:22.223859154Z" level=info msg="Start event monitor"
Oct 19 14:33:22.223892 containerd[2268]: time="2026-10-19T14:33:22.223871063Z" level=info msg="Start cni network conf syncer for default"
Oct 19 14:33:22.224135 containerd[2268]: time="2026-10-19T14:33:22.223878606Z" level=info msg="Start streaming server"
Oct 19 14:33:22.224135 containerd[2268]: time="2026-10-19T14:33:22.224027174Z" level=info msg="Registered namespace \"k8s.io\" with NRI"
Oct 19 14:33:22.224135 containerd[2268]: time="2026-10-19T14:33:22.224034858Z" level=info msg="runtime interface starting up..."
Oct 19 14:33:22.224135 containerd[2268]: time="2026-10-19T14:33:22.224040357Z" level=info msg="starting plugins..."
Oct 19 14:33:22.224135 containerd[2268]: time="2026-10-19T14:33:22.224052338Z" level=info msg="Synchronizing NRI (plugin) with current runtime state"
Oct 19 14:33:22.230558 containerd[2268]: time="2026-10-19T14:33:22.230521410Z" level=info msg="loading plugin" id=io.containerd.server.v1.grpc-tcp type=io.containerd.server.v1
Oct 19 14:33:22.230558 containerd[2268]: time="2026-10-19T14:33:22.230552663Z" level=info msg="skip loading plugin" error="skip plugin" id=io.containerd.server.v1.grpc-tcp type=io.containerd.server.v1
Oct 19 14:33:22.230558 containerd[2268]: time="2026-10-19T14:33:22.230562360Z" level=info msg="loading plugin" id=io.containerd.http.v1.pprof type=io.containerd.http.v1
Oct 19 14:33:22.230742 containerd[2268]: time="2026-10-19T14:33:22.230607468Z" level=info msg="loading plugin" id=io.containerd.server.v1.debug type=io.containerd.server.v1
Oct 19 14:33:22.230742 containerd[2268]: time="2026-10-19T14:33:22.230616312Z" level=info msg="skip loading plugin" error="skip plugin" id=io.containerd.server.v1.debug type=io.containerd.server.v1
Oct 19 14:33:22.230742 containerd[2268]: time="2026-10-19T14:33:22.230685872Z" level=info msg=serving... address=/run/containerd/containerd.sock.ttrpc
Oct 19 14:33:22.230742 containerd[2268]: time="2026-10-19T14:33:22.230701852Z" level=info msg="starting GRPC server" address=/run/containerd/containerd.sock gid=0 uid=0
Oct 19 14:33:22.230742 containerd[2268]: time="2026-10-19T14:33:22.230731157Z" level=info msg=serving... address=/run/containerd/containerd.sock
Oct 19 14:33:22.230899 containerd[2268]: time="2026-10-19T14:33:22.230782827Z" level=info msg="containerd successfully booted in 0.933344s"
Oct 19 14:33:22.230988 systemd[1]: Started containerd.service - containerd container runtime.
Oct 19 14:33:22.234573 systemd[1]: Reached target multi-user.target - Multi-User System.
Oct 19 14:33:22.237286 systemd[1]: Startup finished in 3.981s (kernel) + 47.556s (initrd) + 20.254s (userspace) = 1min 11.792s.
Oct 19 14:33:22.945385 login[2338]: pam_unix(login:session): session opened for user core(uid=500) by LOGIN(uid=0)
Oct 19 14:33:22.945385 login[2339]: pam_unix(login:session): session opened for user core(uid=500) by LOGIN(uid=0)
Oct 19 14:33:22.951882 systemd[1]: Created slice user-500.slice - User Slice of UID 500.
Oct 19 14:33:22.952938 systemd[1]: Starting user-runtime-dir@500.service - User Runtime Directory /run/user/500...
Oct 19 14:33:22.955458 systemd-logind[2241]: New session '2' of user 'core' with class 'user-light' and type 'tty'.
Oct 19 14:33:22.960616 systemd-logind[2241]: New session '1' of user 'core' with class 'user-light' and type 'tty'.
Oct 19 14:33:22.974921 systemd[1]: Finished user-runtime-dir@500.service - User Runtime Directory /run/user/500.
Oct 19 14:33:22.980548 systemd[1]: Started session-1.scope - Session 1 of User core.
Oct 19 14:33:22.981228 systemd[1]: Started session-2.scope - Session 2 of User core.
Oct 19 14:33:23.421795 waagent[2352]: 2026-10-19T14:33:23.421731Z INFO Daemon Daemon Azure Linux Agent Version: 2.12.0.4
Oct 19 14:33:23.448188 waagent[2352]: 2026-10-19T14:33:23.422063Z INFO Daemon Daemon OS: flatcar 9999.9.9
Oct 19 14:33:23.448188 waagent[2352]: 2026-10-19T14:33:23.422521Z INFO Daemon Daemon Python: 3.13.15
Oct 19 14:33:23.448188 waagent[2352]: 2026-10-19T14:33:23.422964Z INFO Daemon Daemon Run daemon
Oct 19 14:33:23.448188 waagent[2352]: 2026-10-19T14:33:23.423443Z INFO Daemon Daemon No RDMA handler exists for distro='Flatcar Container Linux by Kinvolk' version='9999.9.9'
Oct 19 14:33:23.448188 waagent[2352]: 2026-10-19T14:33:23.423568Z INFO Daemon Daemon Using waagent for provisioning
Oct 19 14:33:23.448188 waagent[2352]: 2026-10-19T14:33:23.423728Z INFO Daemon Daemon Activate resource disk
Oct 19 14:33:23.448188 waagent[2352]: 2026-10-19T14:33:23.424111Z INFO Daemon Daemon Searching gen1 prefix 00000000-0001 or gen2 f8b3781a-1e82-4818-a1c3-63d806ec15bb
Oct 19 14:33:23.448188 waagent[2352]: 2026-10-19T14:33:23.425681Z INFO Daemon Daemon Found device: None
Oct 19 14:33:23.448188 waagent[2352]: 2026-10-19T14:33:23.425859Z ERROR Daemon Daemon Failed to mount resource disk [ResourceDiskError] unable to detect disk topology
Oct 19 14:33:23.448188 waagent[2352]: 2026-10-19T14:33:23.426098Z ERROR Daemon Daemon Event: name=WALinuxAgent, op=ActivateResourceDisk, message=[ResourceDiskError] unable to detect disk topology, duration=0
Oct 19 14:33:23.448188 waagent[2352]: 2026-10-19T14:33:23.426688Z INFO Daemon Daemon Clean protocol and wireserver endpoint
Oct 19 14:33:23.448188 waagent[2352]: 2026-10-19T14:33:23.426825Z INFO Daemon Daemon Running default provisioning handler
Oct 19 14:33:23.448188 waagent[2352]: 2026-10-19T14:33:23.435213Z 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.
Oct 19 14:33:23.448188 waagent[2352]: 2026-10-19T14:33:23.438316Z INFO Daemon Daemon Unable to get cloud-init enabled status from service: [Errno 2] No such file or directory: 'service'
Oct 19 14:33:23.448188 waagent[2352]: 2026-10-19T14:33:23.438636Z INFO Daemon Daemon cloud-init is enabled: False
Oct 19 14:33:23.448188 waagent[2352]: 2026-10-19T14:33:23.438902Z INFO Daemon Daemon Copying ovf-env.xml
Oct 19 14:33:23.555273 waagent[2352]: 2026-10-19T14:33:23.555215Z INFO Daemon Daemon Successfully mounted dvd
Oct 19 14:33:23.600985 systemd[1]: mnt-cdrom-secure.mount: Deactivated successfully.
Oct 19 14:33:23.650791 waagent[2352]: 2026-10-19T14:33:23.650746Z INFO Daemon Daemon Detect protocol endpoint
Oct 19 14:33:23.651760 waagent[2352]: 2026-10-19T14:33:23.651727Z INFO Daemon Daemon Clean protocol and wireserver endpoint
Oct 19 14:33:23.652840 waagent[2352]: 2026-10-19T14:33:23.652698Z INFO Daemon Daemon WireServer endpoint is not found. Rerun dhcp handler
Oct 19 14:33:23.653486 waagent[2352]: 2026-10-19T14:33:23.653459Z INFO Daemon Daemon Test for route to 168.63.129.16
Oct 19 14:33:23.655459 waagent[2352]: 2026-10-19T14:33:23.655420Z INFO Daemon Daemon Route to 168.63.129.16 exists
Oct 19 14:33:23.656306 waagent[2352]: 2026-10-19T14:33:23.656045Z INFO Daemon Daemon Wire server endpoint:168.63.129.16
Oct 19 14:33:23.829139 waagent[2352]: 2026-10-19T14:33:23.829102Z INFO Daemon Daemon Fabric preferred wire protocol version:2015-04-05
Oct 19 14:33:23.830793 waagent[2352]: 2026-10-19T14:33:23.830765Z INFO Daemon Daemon Wire protocol version:2012-11-30
Oct 19 14:33:23.831883 waagent[2352]: 2026-10-19T14:33:23.831855Z INFO Daemon Daemon Server preferred version:2015-04-05
Oct 19 14:33:23.949750 waagent[2352]: 2026-10-19T14:33:23.949691Z INFO Daemon Daemon Initializing goal state during protocol detection
Oct 19 14:33:23.951506 waagent[2352]: 2026-10-19T14:33:23.949888Z INFO Daemon Daemon Forcing an update of the goal state.
Oct 19 14:33:23.956229 waagent[2352]: 2026-10-19T14:33:23.956189Z INFO Daemon Fetched a new incarnation for the WireServer goal state [incarnation 1]
Oct 19 14:33:23.976772 waagent[2352]: 2026-10-19T14:33:23.976737Z INFO Daemon Daemon HostGAPlugin version: 1.0.8.189
Oct 19 14:33:23.980108 waagent[2352]: 2026-10-19T14:33:23.977275Z INFO Daemon
Oct 19 14:33:23.980108 waagent[2352]: 2026-10-19T14:33:23.977538Z INFO Daemon Fetched new vmSettings [HostGAPlugin correlation ID: 8bb4f728-2acb-46f0-805f-fb2af076ac55 eTag: 10242904727760645449 source: Fabric]
Oct 19 14:33:23.980108 waagent[2352]: 2026-10-19T14:33:23.978121Z INFO Daemon The vmSettings originated via Fabric; will ignore them.
Oct 19 14:33:23.980108 waagent[2352]: 2026-10-19T14:33:23.978447Z INFO Daemon
Oct 19 14:33:23.980108 waagent[2352]: 2026-10-19T14:33:23.978628Z INFO Daemon Fetching full goal state from the WireServer [incarnation 1]
Oct 19 14:33:23.986039 waagent[2352]: 2026-10-19T14:33:23.986010Z INFO Daemon Daemon Downloading artifacts profile blob
Oct 19 14:33:24.054427 waagent[2352]: 2026-10-19T14:33:24.054380Z INFO Daemon Downloaded certificate {'thumbprint': '9356F4B70FC26936CF20B7B5868E6777822AB9FB', 'hasPrivateKey': True}
Oct 19 14:33:24.054894 waagent[2352]: 2026-10-19T14:33:24.054819Z INFO Daemon Fetch goal state completed
Oct 19 14:33:24.061245 waagent[2352]: 2026-10-19T14:33:24.061201Z INFO Daemon Daemon Starting provisioning
Oct 19 14:33:24.062413 waagent[2352]: 2026-10-19T14:33:24.061356Z INFO Daemon Daemon Handle ovf-env.xml.
Oct 19 14:33:24.062413 waagent[2352]: 2026-10-19T14:33:24.061529Z INFO Daemon Daemon Set hostname [ci-9999.9.9-e-dd7c10426c]
Oct 19 14:33:24.070109 systemd-networkd[2031]: eth0: Reconfiguring with /usr/lib/systemd/network/zz-default.network.
Oct 19 14:33:24.070622 waagent[2352]: 2026-10-19T14:33:24.063228Z INFO Daemon Daemon Publish hostname [ci-9999.9.9-e-dd7c10426c]
Oct 19 14:33:24.070622 waagent[2352]: 2026-10-19T14:33:24.063605Z INFO Daemon Daemon Examine /proc/net/route for primary interface
Oct 19 14:33:24.070622 waagent[2352]: 2026-10-19T14:33:24.063922Z INFO Daemon Daemon Primary interface is [eth0]
Oct 19 14:33:24.070185 systemd-networkd[2031]: eth0: DHCP lease lost
Oct 19 14:33:24.083060 waagent[2352]: 2026-10-19T14:33:24.082994Z INFO Daemon Daemon Create user account if not exists
Oct 19 14:33:24.086201 waagent[2352]: 2026-10-19T14:33:24.083233Z INFO Daemon Daemon User core already exists, skip useradd
Oct 19 14:33:24.086201 waagent[2352]: 2026-10-19T14:33:24.083378Z INFO Daemon Daemon Configure sudoer
Oct 19 14:33:24.086201 waagent[2352]: 2026-10-19T14:33:24.083843Z INFO Daemon Daemon Configure sshd
Oct 19 14:33:24.086201 waagent[2352]: 2026-10-19T14:33:24.084103Z INFO Daemon Daemon Added a configuration snippet disabling SSH password-based authentication methods. It also configures SSH client probing to keep connections alive.
Oct 19 14:33:24.086201 waagent[2352]: 2026-10-19T14:33:24.084579Z INFO Daemon Daemon Deploy ssh public key.
Oct 19 14:33:24.103644 systemd-networkd[2031]: eth0: DHCPv4 address 10.0.0.23/24, gateway 10.0.0.1 acquired from 168.63.129.16
Oct 19 14:33:25.164462 waagent[2352]: 2026-10-19T14:33:25.164402Z INFO Daemon Daemon Provisioning complete
Oct 19 14:33:25.170856 waagent[2352]: 2026-10-19T14:33:25.170823Z INFO Daemon Daemon RDMA capabilities are not enabled, skipping
Oct 19 14:33:25.171897 waagent[2352]: 2026-10-19T14:33:25.171047Z INFO Daemon Daemon End of log to /dev/console. The agent will now check for updates and then will process extensions.
Oct 19 14:33:25.171897 waagent[2352]: 2026-10-19T14:33:25.171291Z INFO Daemon Daemon Installed Agent WALinuxAgent-2.12.0.4 is the most current agent
Oct 19 14:33:25.277027 waagent[2441]: 2026-10-19T14:33:25.276956Z INFO ExtHandler ExtHandler Azure Linux Agent (Goal State Agent version 2.12.0.4)
Oct 19 14:33:25.277342 waagent[2441]: 2026-10-19T14:33:25.277059Z INFO ExtHandler ExtHandler OS: flatcar 9999.9.9
Oct 19 14:33:25.277342 waagent[2441]: 2026-10-19T14:33:25.277132Z INFO ExtHandler ExtHandler Python: 3.13.15
Oct 19 14:33:25.277342 waagent[2441]: 2026-10-19T14:33:25.277178Z INFO ExtHandler ExtHandler CPU Arch: x86_64
Oct 19 14:33:25.312609 waagent[2441]: 2026-10-19T14:33:25.312561Z INFO ExtHandler ExtHandler Distro: flatcar-9999.9.9; OSUtil: FlatcarUtil; AgentService: waagent; Python: 3.13.15; Arch: x86_64; systemd: True; LISDrivers: Absent; logrotate: logrotate 3.22.0;
Oct 19 14:33:25.312740 waagent[2441]: 2026-10-19T14:33:25.312715Z INFO ExtHandler ExtHandler WireServer endpoint 168.63.129.16 read from file
Oct 19 14:33:25.312796 waagent[2441]: 2026-10-19T14:33:25.312776Z INFO ExtHandler ExtHandler Wire server endpoint:168.63.129.16
Oct 19 14:33:25.323072 waagent[2441]: 2026-10-19T14:33:25.323015Z INFO ExtHandler Fetched a new incarnation for the WireServer goal state [incarnation 1]
Oct 19 14:33:25.328402 waagent[2441]: 2026-10-19T14:33:25.328374Z INFO ExtHandler ExtHandler HostGAPlugin version: 1.0.8.189
Oct 19 14:33:25.328734 waagent[2441]: 2026-10-19T14:33:25.328706Z INFO ExtHandler
Oct 19 14:33:25.328791 waagent[2441]: 2026-10-19T14:33:25.328769Z INFO ExtHandler Fetched new vmSettings [HostGAPlugin correlation ID: e2b1f898-2591-4653-a292-06146739a98b eTag: 10242904727760645449 source: Fabric]
Oct 19 14:33:25.328982 waagent[2441]: 2026-10-19T14:33:25.328960Z INFO ExtHandler The vmSettings originated via Fabric; will ignore them.
Oct 19 14:33:25.329339 waagent[2441]: 2026-10-19T14:33:25.329312Z INFO ExtHandler
Oct 19 14:33:25.329386 waagent[2441]: 2026-10-19T14:33:25.329361Z INFO ExtHandler Fetching full goal state from the WireServer [incarnation 1]
Oct 19 14:33:25.332329 waagent[2441]: 2026-10-19T14:33:25.332306Z INFO ExtHandler ExtHandler Downloading artifacts profile blob
Oct 19 14:33:25.400997 waagent[2441]: 2026-10-19T14:33:25.400945Z INFO ExtHandler Downloaded certificate {'thumbprint': '9356F4B70FC26936CF20B7B5868E6777822AB9FB', 'hasPrivateKey': True}
Oct 19 14:33:25.401377 waagent[2441]: 2026-10-19T14:33:25.401344Z INFO ExtHandler Fetch goal state completed
Oct 19 14:33:25.411711 waagent[2441]: 2026-10-19T14:33:25.411666Z INFO ExtHandler ExtHandler OpenSSL version: OpenSSL 3.6.5 29 Sep 2026 (Library: OpenSSL 3.6.5 29 Sep 2026)
Oct 19 14:33:25.414688 waagent[2441]: 2026-10-19T14:33:25.414616Z INFO ExtHandler ExtHandler WALinuxAgent-2.12.0.4 running as process 2441
Oct 19 14:33:25.414771 waagent[2441]: 2026-10-19T14:33:25.414740Z INFO ExtHandler ExtHandler ******** AutoUpdate.Enabled is set to False, not processing the operation ********
Oct 19 14:33:25.415002 waagent[2441]: 2026-10-19T14:33:25.414979Z INFO ExtHandler ExtHandler ******** AutoUpdate.UpdateToLatestVersion is set to False, not processing the operation ********
Oct 19 14:33:25.416022 waagent[2441]: 2026-10-19T14:33:25.415987Z INFO ExtHandler ExtHandler [CGI] Cgroup monitoring is not supported on ['flatcar', '9999.9.9', '', 'Flatcar Container Linux by Kinvolk']
Oct 19 14:33:25.416330 waagent[2441]: 2026-10-19T14:33:25.416303Z INFO ExtHandler ExtHandler [CGI] Agent will reset the quotas in case distro: ['flatcar', '9999.9.9', '', 'Flatcar Container Linux by Kinvolk'] went from supported to unsupported
Oct 19 14:33:25.416422 waagent[2441]: 2026-10-19T14:33:25.416401Z INFO ExtHandler ExtHandler [CGI] Agent cgroups enabled: False
Oct 19 14:33:25.416800 waagent[2441]: 2026-10-19T14:33:25.416777Z INFO ExtHandler ExtHandler Starting setup for Persistent firewall rules
Oct 19 14:33:25.448897 waagent[2441]: 2026-10-19T14:33:25.448870Z INFO ExtHandler ExtHandler Firewalld service not running/unavailable, trying to set up waagent-network-setup.service
Oct 19 14:33:25.449020 waagent[2441]: 2026-10-19T14:33:25.448997Z INFO ExtHandler ExtHandler Successfully updated the Binary file /var/lib/waagent/waagent-network-setup.py for firewall setup
Oct 19 14:33:25.453283 waagent[2441]: 2026-10-19T14:33:25.452905Z INFO ExtHandler ExtHandler Service: waagent-network-setup.service not enabled. Adding it now
Oct 19 14:33:25.457320 systemd[1]: Reload requested from client PID 2456 ('systemctl') (unit waagent.service)...
Oct 19 14:33:25.457336 systemd[1]: Reloading...
Oct 19 14:33:25.522159 zram_generator::config[2500]: No configuration found.
Oct 19 14:33:25.649106 kernel: hv_storvsc f8b3781a-1e82-4818-a1c3-63d806ec15bb: tag#278 cmd 0x4a status: scsi 0x0 srb 0x20 host 0xc0000001
Oct 19 14:33:25.766458 systemd[1]: Reloading finished in 308 ms.
Oct 19 14:33:25.802106 waagent[2441]: 2026-10-19T14:33:25.801764Z INFO ExtHandler ExtHandler Successfully added and enabled the waagent-network-setup.service
Oct 19 14:33:25.802106 waagent[2441]: 2026-10-19T14:33:25.801900Z INFO ExtHandler ExtHandler Persistent firewall rules setup successfully
Oct 19 14:33:26.120418 waagent[2441]: 2026-10-19T14:33:26.120359Z INFO ExtHandler ExtHandler DROP rule is not available which implies no firewall rules are set yet. Environment thread will set it up.
Oct 19 14:33:26.120670 waagent[2441]: 2026-10-19T14:33:26.120642Z 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]
Oct 19 14:33:26.121349 waagent[2441]: 2026-10-19T14:33:26.121281Z INFO ExtHandler ExtHandler Starting env monitor service.
Oct 19 14:33:26.121719 waagent[2441]: 2026-10-19T14:33:26.121689Z INFO ExtHandler ExtHandler Start SendTelemetryHandler service.
Oct 19 14:33:26.121855 waagent[2441]: 2026-10-19T14:33:26.121777Z INFO EnvHandler ExtHandler WireServer endpoint 168.63.129.16 read from file
Oct 19 14:33:26.121855 waagent[2441]: 2026-10-19T14:33:26.121824Z INFO MonitorHandler ExtHandler WireServer endpoint 168.63.129.16 read from file
Oct 19 14:33:26.121931 waagent[2441]: 2026-10-19T14:33:26.121906Z INFO EnvHandler ExtHandler Wire server endpoint:168.63.129.16
Oct 19 14:33:26.122094 waagent[2441]: 2026-10-19T14:33:26.122051Z INFO EnvHandler ExtHandler Configure routes
Oct 19 14:33:26.122215 waagent[2441]: 2026-10-19T14:33:26.122190Z INFO EnvHandler ExtHandler Gateway:None
Oct 19 14:33:26.122268 waagent[2441]: 2026-10-19T14:33:26.122247Z INFO EnvHandler ExtHandler Routes:None
Oct 19 14:33:26.122600 waagent[2441]: 2026-10-19T14:33:26.122575Z INFO MonitorHandler ExtHandler Wire server endpoint:168.63.129.16
Oct 19 14:33:26.122911 waagent[2441]: 2026-10-19T14:33:26.122632Z INFO SendTelemetryHandler ExtHandler Successfully started the SendTelemetryHandler thread
Oct 19 14:33:26.122911 waagent[2441]: 2026-10-19T14:33:26.122875Z INFO MonitorHandler ExtHandler Monitor.NetworkConfigurationChanges is disabled.
Oct 19 14:33:26.123201 waagent[2441]: 2026-10-19T14:33:26.123178Z INFO ExtHandler ExtHandler Start Extension Telemetry service.
Oct 19 14:33:26.123736 waagent[2441]: 2026-10-19T14:33:26.123707Z INFO TelemetryEventsCollector ExtHandler Extension Telemetry pipeline enabled: True
Oct 19 14:33:26.123820 waagent[2441]: 2026-10-19T14:33:26.123799Z INFO ExtHandler ExtHandler Goal State Period: 6 sec. This indicates how often the agent checks for new goal states and reports status.
Oct 19 14:33:26.124180 waagent[2441]: 2026-10-19T14:33:26.124151Z INFO TelemetryEventsCollector ExtHandler Successfully started the TelemetryEventsCollector thread
Oct 19 14:33:26.124264 waagent[2441]: 2026-10-19T14:33:26.124244Z INFO MonitorHandler ExtHandler Routing table from /proc/net/route:
Oct 19 14:33:26.124264 waagent[2441]: Iface        Destination        Gateway         Flags        RefCnt        Use        Metric        Mask                MTU        Window        IRTT
Oct 19 14:33:26.124264 waagent[2441]: eth0        00000000        0100000A        0003        0        0        1024        00000000        0        0        0
Oct 19 14:33:26.124264 waagent[2441]: eth0        0000000A        00000000        0001        0        0        1024        00FFFFFF        0        0        0
Oct 19 14:33:26.124264 waagent[2441]: eth0        0100000A        00000000        0005        0        0        1024        FFFFFFFF        0        0        0
Oct 19 14:33:26.124264 waagent[2441]: eth0        10813FA8        0100000A        0007        0        0        1024        FFFFFFFF        0        0        0
Oct 19 14:33:26.124264 waagent[2441]: eth0        FEA9FEA9        0100000A        0007        0        0        1024        FFFFFFFF        0        0        0
Oct 19 14:33:26.138434 waagent[2441]: 2026-10-19T14:33:26.138394Z INFO ExtHandler ExtHandler
Oct 19 14:33:26.138493 waagent[2441]: 2026-10-19T14:33:26.138464Z INFO ExtHandler ExtHandler ProcessExtensionsGoalState started [incarnation_1 channel: WireServer source: Fabric activity: f93b5528-022f-4f1c-afec-fd86166a6153 correlation fa72a133-6029-4d25-a5c0-1bdea59adc17 created: 2026-10-19T14:31:39.605225Z]
Oct 19 14:33:26.138738 waagent[2441]: 2026-10-19T14:33:26.138711Z INFO ExtHandler ExtHandler No extension handlers found, not processing anything.
Oct 19 14:33:26.139172 waagent[2441]: 2026-10-19T14:33:26.139148Z INFO ExtHandler ExtHandler ProcessExtensionsGoalState completed [incarnation_1 0 ms]
Oct 19 14:33:26.169196 waagent[2441]: 2026-10-19T14:33:26.169002Z INFO ExtHandler ExtHandler [HEARTBEAT] Agent WALinuxAgent-2.12.0.4 is running as the goal state agent [DEBUG HeartbeatCounter: 0;HeartbeatId: BB9A96C0-0505-4A5F-9627-A2589C78EEAA;DroppedPackets: 0;UpdateGSErrors: 0;AutoUpdate: 0;UpdateMode: SelfUpdate;]
Oct 19 14:33:26.207068 waagent[2441]: 2026-10-19T14:33:26.207022Z INFO MonitorHandler ExtHandler Network interfaces:
Oct 19 14:33:26.207068 waagent[2441]: Executing ['ip', '-a', '-o', 'link']:
Oct 19 14:33:26.207068 waagent[2441]: 1: lo: <LOOPBACK,UP,LOWER_UP> 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
Oct 19 14:33:26.207068 waagent[2441]: 2: eth0: <BROADCAST,MULTICAST,UP,LOWER_UP> mtu 1500 qdisc mq state UP mode DEFAULT group default qlen 1000\    link/ether 00:0d:3a:d9:e1:b2 brd ff:ff:ff:ff:ff:ff\    alias Network Device\    altname enx000d3ad9e1b2
Oct 19 14:33:26.207068 waagent[2441]: 3: enP30832s1: <BROADCAST,MULTICAST,SLAVE,UP,LOWER_UP> mtu 1500 qdisc mq master eth0 state UP mode DEFAULT group default qlen 1000\    link/ether 00:0d:3a:d9:e1:b2 brd ff:ff:ff:ff:ff:ff\    altname enP30832p0s0\    altname enp0s0\    altname ens1
Oct 19 14:33:26.207068 waagent[2441]: Executing ['ip', '-4', '-a', '-o', 'address']:
Oct 19 14:33:26.207068 waagent[2441]: 1: lo    inet 127.0.0.1/8 scope host lo\       valid_lft forever preferred_lft forever
Oct 19 14:33:26.207068 waagent[2441]: 2: eth0    inet 10.0.0.23/24 metric 1024 brd 10.0.0.255 scope global eth0\       valid_lft forever preferred_lft forever
Oct 19 14:33:26.207068 waagent[2441]: Executing ['ip', '-6', '-a', '-o', 'address']:
Oct 19 14:33:26.207068 waagent[2441]: 1: lo    inet6 ::1/128 scope host noprefixroute \       valid_lft forever preferred_lft forever
Oct 19 14:33:26.207068 waagent[2441]: 2: eth0    inet6 fe80::20d:3aff:fed9:e1b2/64 scope link proto kernel_ll \       valid_lft forever preferred_lft forever
Oct 19 14:33:26.222662 waagent[2441]: 2026-10-19T14:33:26.222615Z INFO EnvHandler ExtHandler Created firewall rules for the Azure Fabric:
Oct 19 14:33:26.222662 waagent[2441]: Chain INPUT (policy ACCEPT 0 packets, 0 bytes)
Oct 19 14:33:26.222662 waagent[2441]:     pkts      bytes target     prot opt in     out     source               destination
Oct 19 14:33:26.222662 waagent[2441]: Chain FORWARD (policy ACCEPT 0 packets, 0 bytes)
Oct 19 14:33:26.222662 waagent[2441]:     pkts      bytes target     prot opt in     out     source               destination
Oct 19 14:33:26.222662 waagent[2441]: Chain OUTPUT (policy ACCEPT 0 packets, 0 bytes)
Oct 19 14:33:26.222662 waagent[2441]:     pkts      bytes target     prot opt in     out     source               destination
Oct 19 14:33:26.222662 waagent[2441]:        0        0 ACCEPT     tcp  --  *      *       0.0.0.0/0            168.63.129.16        tcp dpt:53
Oct 19 14:33:26.222662 waagent[2441]:        0        0 ACCEPT     tcp  --  *      *       0.0.0.0/0            168.63.129.16        owner UID match 0
Oct 19 14:33:26.222662 waagent[2441]:        0        0 DROP       tcp  --  *      *       0.0.0.0/0            168.63.129.16        ctstate INVALID,NEW
Oct 19 14:33:26.225630 waagent[2441]: 2026-10-19T14:33:26.225583Z INFO EnvHandler ExtHandler Current Firewall rules:
Oct 19 14:33:26.225630 waagent[2441]: Chain INPUT (policy ACCEPT 0 packets, 0 bytes)
Oct 19 14:33:26.225630 waagent[2441]:     pkts      bytes target     prot opt in     out     source               destination
Oct 19 14:33:26.225630 waagent[2441]: Chain FORWARD (policy ACCEPT 0 packets, 0 bytes)
Oct 19 14:33:26.225630 waagent[2441]:     pkts      bytes target     prot opt in     out     source               destination
Oct 19 14:33:26.225630 waagent[2441]: Chain OUTPUT (policy ACCEPT 0 packets, 0 bytes)
Oct 19 14:33:26.225630 waagent[2441]:     pkts      bytes target     prot opt in     out     source               destination
Oct 19 14:33:26.225630 waagent[2441]:        0        0 ACCEPT     tcp  --  *      *       0.0.0.0/0            168.63.129.16        tcp dpt:53
Oct 19 14:33:26.225630 waagent[2441]:        4      406 ACCEPT     tcp  --  *      *       0.0.0.0/0            168.63.129.16        owner UID match 0
Oct 19 14:33:26.225630 waagent[2441]:        0        0 DROP       tcp  --  *      *       0.0.0.0/0            168.63.129.16        ctstate INVALID,NEW
Oct 19 14:33:41.987039 chronyd[2226]: Selected source PHC0
Oct 19 14:33:56.900456 systemd[1]: Created slice system-sshd.slice - Slice /system/sshd.
Oct 19 14:33:56.901623 systemd[1]: Started sshd@0-1-10.0.0.23:22-20.76.155.168:32930.service - OpenSSH per-connection server daemon (20.76.155.168:32930).
Oct 19 14:33:57.170526 sshd[2597]: Accepted publickey for core from 20.76.155.168 port 32930 ssh2: RSA SHA256:HrEdI9shwGH/Mm+9Dn9ES3Lg/10ptUsFo/5kSKgIZsM
Oct 19 14:33:57.171544 sshd-session[2597]: pam_unix(sshd:session): session opened for user core(uid=500) by core(uid=0)
Oct 19 14:33:57.182048 systemd[1]: Starting user@500.service - User Manager for UID 500...
Oct 19 14:33:57.185104 systemd-logind[2241]: New session '3' of user 'core' with class 'user' and type 'tty'.
Oct 19 14:33:57.190233 (systemd)[2601]: pam_unix(systemd-user:session): session opened for user core(uid=500) by core(uid=0)
Oct 19 14:33:57.192252 systemd-logind[2241]: New session '4' of user 'core' with class 'manager-early' and type 'unspecified'.
Oct 19 14:33:57.429721 systemd[2601]: Queued start job for default target default.target.
Oct 19 14:33:57.434793 systemd[2601]: Created slice app.slice - User Application Slice.
Oct 19 14:33:57.434824 systemd[2601]: Started systemd-tmpfiles-clean.timer - Daily Cleanup of User's Temporary Directories.
Oct 19 14:33:57.434840 systemd[2601]: Reached target machines.target - Virtual Machines and Containers.
Oct 19 14:33:57.434885 systemd[2601]: Reached target paths.target - Paths.
Oct 19 14:33:57.434909 systemd[2601]: Reached target timers.target - Timers.
Oct 19 14:33:57.435819 systemd[2601]: Starting dbus.socket - D-Bus User Message Bus Socket...
Oct 19 14:33:57.437414 systemd[2601]: Listening on systemd-ask-password.socket - Query the User Interactively for a Password.
Oct 19 14:33:57.437563 systemd[2601]: Listening on systemd-importd.socket - Disk Image Download Service Socket.
Oct 19 14:33:57.438554 systemd[2601]: Listening on systemd-journalctl.socket - Journal Log Access Socket.
Oct 19 14:33:57.438766 systemd[2601]: Listening on systemd-machined.socket - Virtual Machine and Container Registration Service Socket.
Oct 19 14:33:57.440152 systemd[2601]: Listening on systemd-storage-fs.socket - Simple File System Backed Storage Provider.
Oct 19 14:33:57.440759 systemd[2601]: Starting systemd-tmpfiles-setup.service - Create User Files and Directories...
Oct 19 14:33:57.448163 systemd[2601]: Listening on dbus.socket - D-Bus User Message Bus Socket.
Oct 19 14:33:57.449308 systemd[2601]: Reached target sockets.target - Sockets.
Oct 19 14:33:57.451450 systemd[2601]: Finished systemd-tmpfiles-setup.service - Create User Files and Directories.
Oct 19 14:33:57.451659 systemd[2601]: Reached target basic.target - Basic System.
Oct 19 14:33:57.451773 systemd[2601]: Reached target default.target - Main User Target.
Oct 19 14:33:57.451851 systemd[2601]: Startup finished in 255ms.
Oct 19 14:33:57.451920 systemd[1]: Started user@500.service - User Manager for UID 500.
Oct 19 14:33:57.453076 systemd[1]: Started session-3.scope - Session 3 of User core.
Oct 19 14:33:57.521286 systemd[1]: Started sshd@1-2-10.0.0.23:22-20.76.155.168:32944.service - OpenSSH per-connection server daemon (20.76.155.168:32944).
Oct 19 14:33:57.625484 sshd[2615]: Accepted publickey for core from 20.76.155.168 port 32944 ssh2: RSA SHA256:HrEdI9shwGH/Mm+9Dn9ES3Lg/10ptUsFo/5kSKgIZsM
Oct 19 14:33:57.626541 sshd-session[2615]: pam_unix(sshd:session): session opened for user core(uid=500) by core(uid=0)
Oct 19 14:33:57.630721 systemd-logind[2241]: New session '5' of user 'core' with class 'user' and type 'tty'.
Oct 19 14:33:57.635266 systemd[1]: Started session-5.scope - Session 5 of User core.
Oct 19 14:33:57.670839 sshd[2619]: Connection closed by 20.76.155.168 port 32944
Oct 19 14:33:57.672110 sshd-session[2615]: pam_unix(sshd:session): session closed for user core
Oct 19 14:33:57.674303 systemd[1]: sshd@1-2-10.0.0.23:22-20.76.155.168:32944.service: Deactivated successfully.
Oct 19 14:33:57.675851 systemd[1]: session-5.scope: Deactivated successfully.
Oct 19 14:33:57.676599 systemd-logind[2241]: Session 5 logged out. Waiting for processes to exit.
Oct 19 14:33:57.677771 systemd-logind[2241]: Removed session 5.
Oct 19 14:33:57.693338 systemd[1]: Started sshd@2-3-10.0.0.23:22-20.76.155.168:32950.service - OpenSSH per-connection server daemon (20.76.155.168:32950).
Oct 19 14:33:57.797319 sshd[2625]: Accepted publickey for core from 20.76.155.168 port 32950 ssh2: RSA SHA256:HrEdI9shwGH/Mm+9Dn9ES3Lg/10ptUsFo/5kSKgIZsM
Oct 19 14:33:57.798290 sshd-session[2625]: pam_unix(sshd:session): session opened for user core(uid=500) by core(uid=0)
Oct 19 14:33:57.802389 systemd-logind[2241]: New session '6' of user 'core' with class 'user' and type 'tty'.
Oct 19 14:33:57.807254 systemd[1]: Started session-6.scope - Session 6 of User core.
Oct 19 14:33:57.814101 kernel: hv_balloon: Max. dynamic memory size: 8192 MB
Oct 19 14:33:57.840256 sshd[2629]: Connection closed by 20.76.155.168 port 32950
Oct 19 14:33:57.841504 sshd-session[2625]: pam_unix(sshd:session): session closed for user core
Oct 19 14:33:57.843544 systemd[1]: sshd@2-3-10.0.0.23:22-20.76.155.168:32950.service: Deactivated successfully.
Oct 19 14:33:57.845163 systemd[1]: session-6.scope: Deactivated successfully.
Oct 19 14:33:57.845870 systemd-logind[2241]: Session 6 logged out. Waiting for processes to exit.
Oct 19 14:33:57.847056 systemd-logind[2241]: Removed session 6.
Oct 19 14:33:57.862178 systemd[1]: Started sshd@3-4-10.0.0.23:22-20.76.155.168:32966.service - OpenSSH per-connection server daemon (20.76.155.168:32966).
Oct 19 14:33:57.969526 sshd[2635]: Accepted publickey for core from 20.76.155.168 port 32966 ssh2: RSA SHA256:HrEdI9shwGH/Mm+9Dn9ES3Lg/10ptUsFo/5kSKgIZsM
Oct 19 14:33:57.970479 sshd-session[2635]: pam_unix(sshd:session): session opened for user core(uid=500) by core(uid=0)
Oct 19 14:33:57.974620 systemd-logind[2241]: New session '7' of user 'core' with class 'user' and type 'tty'.
Oct 19 14:33:57.979263 systemd[1]: Started session-7.scope - Session 7 of User core.
Oct 19 14:33:58.014641 sshd[2639]: Connection closed by 20.76.155.168 port 32966
Oct 19 14:33:58.015038 sshd-session[2635]: pam_unix(sshd:session): session closed for user core
Oct 19 14:33:58.017333 systemd[1]: sshd@3-4-10.0.0.23:22-20.76.155.168:32966.service: Deactivated successfully.
Oct 19 14:33:58.018717 systemd[1]: session-7.scope: Deactivated successfully.
Oct 19 14:33:58.019428 systemd-logind[2241]: Session 7 logged out. Waiting for processes to exit.
Oct 19 14:33:58.020551 systemd-logind[2241]: Removed session 7.
Oct 19 14:33:58.040312 systemd[1]: Started sshd@4-4097-10.0.0.23:22-20.76.155.168:32972.service - OpenSSH per-connection server daemon (20.76.155.168:32972).
Oct 19 14:33:58.146485 sshd[2645]: Accepted publickey for core from 20.76.155.168 port 32972 ssh2: RSA SHA256:HrEdI9shwGH/Mm+9Dn9ES3Lg/10ptUsFo/5kSKgIZsM
Oct 19 14:33:58.147461 sshd-session[2645]: pam_unix(sshd:session): session opened for user core(uid=500) by core(uid=0)
Oct 19 14:33:58.151486 systemd-logind[2241]: New session '8' of user 'core' with class 'user' and type 'tty'.
Oct 19 14:33:58.153269 systemd[1]: Started session-8.scope - Session 8 of User core.
Oct 19 14:33:58.296420 sudo[2651]:     core : PWD=/home/core ; USER=root ; COMMAND=/usr/sbin/ig run trace_exec:v0.50.0 --help
Oct 19 14:33:58.296651 sudo[2651]: pam_unix(sudo:session): session opened for user root(uid=0) by core(uid=500)
Oct 19 14:33:59.231578 systemd[1]: Starting docker.service - Docker Application Container Engine...
Oct 19 14:33:59.241012 (dockerd)[2657]: docker.service: Referenced but unset environment variable evaluates to an empty string: DOCKER_CGROUPS, DOCKER_OPTS, DOCKER_OPT_BIP, DOCKER_OPT_IPMASQ, DOCKER_OPT_MTU
Oct 19 14:34:04.449900 update_engine[2242]: I20261019 14:34:04.449836  2242 update_attempter.cc:509] Updating boot flags...
Oct 19 14:34:05.704751 dockerd[2657]: time="2026-10-19T14:34:05.704700435Z" level=info msg="Starting up"
Oct 19 14:34:05.707037 dockerd[2657]: time="2026-10-19T14:34:05.706998919Z" level=info msg="OTEL tracing is not configured, using no-op tracer provider"
Oct 19 14:34:05.707215 dockerd[2657]: time="2026-10-19T14:34:05.707127801Z" level=info msg="CDI directory does not exist, skipping" dir=/etc/cdi
Oct 19 14:34:05.707215 dockerd[2657]: time="2026-10-19T14:34:05.707138716Z" level=info msg="CDI directory does not exist, skipping" dir=/var/run/cdi
Oct 19 14:34:05.717517 dockerd[2657]: time="2026-10-19T14:34:05.717484478Z" level=info msg="Creating a containerd client" address=/var/run/docker/libcontainerd/docker-containerd.sock timeout=1m0s
Oct 19 14:34:05.719061 dockerd[2657]: time="2026-10-19T14:34:05.718987062Z" level=warning msg="failed check for fsverity support" error="enable fsverity failed: operation not supported" path=/var/lib/docker/plugins/storage
Oct 19 14:34:05.747250 dockerd[2657]: time="2026-10-19T14:34:05.747212154Z" level=info msg="Loading containers: start."
Oct 19 14:34:05.747338 dockerd[2657]: time="2026-10-19T14:34:05.747326974Z" level=info msg="NRI is disabled"
Oct 19 14:34:05.747362 dockerd[2657]: time="2026-10-19T14:34:05.747337022Z" level=info msg="Starting daemon with containerd snapshotter integration enabled"
Oct 19 14:34:05.780478 dockerd[2657]: time="2026-10-19T14:34:05.780416084Z" level=info msg="Restoring containers: start."
Oct 19 14:34:05.857417 dockerd[2657]: time="2026-10-19T14:34:05.857389787Z" level=info msg="Deleting nftables IPv4 rules" error="running nft: /dev/stdin:1:17-30: Error: Could not process rule: No such file or directory\ndelete table ip docker-bridges\n                ^^^^^^^^^^^^^^\n exit status 1"
Oct 19 14:34:05.866403 dockerd[2657]: time="2026-10-19T14:34:05.866376764Z" level=info msg="Deleting nftables IPv6 rules" error="running nft: /dev/stdin:1:18-31: Error: Could not process rule: No such file or directory\ndelete table ip6 docker-bridges\n                 ^^^^^^^^^^^^^^\n exit status 1"
Oct 19 14:34:06.086124 kernel: Initializing XFRM netlink socket
Oct 19 14:34:06.250828 systemd-networkd[2031]: docker0: Link UP
Oct 19 14:34:06.292054 dockerd[2657]: time="2026-10-19T14:34:06.292020284Z" level=info msg="Loading containers: done."
Oct 19 14:34:06.476495 dockerd[2657]: time="2026-10-19T14:34:06.476379908Z" level=info msg="Docker daemon" commit=3ce5872b7950c63ba2ffbc5123101019ff3e6682 containerd-snapshotter=true storage-driver=overlayfs version=29.8.0
Oct 19 14:34:06.476764 dockerd[2657]: time="2026-10-19T14:34:06.476732156Z" level=info msg="Initializing buildkit"
Oct 19 14:34:06.885561 dockerd[2657]: time="2026-10-19T14:34:06.885517753Z" level=info msg="Completed buildkit initialization"
Oct 19 14:34:06.893141 dockerd[2657]: time="2026-10-19T14:34:06.893100450Z" level=info msg="Daemon has completed initialization"
Oct 19 14:34:06.893260 dockerd[2657]: time="2026-10-19T14:34:06.893176484Z" level=info msg="API listen on /run/docker.sock"
Oct 19 14:34:06.894944 systemd[1]: Started docker.service - Docker Application Container Engine.
Oct 19 14:34:08.707321 sudo[2651]: pam_unix(sudo:session): session closed for user root
Oct 19 14:34:08.713423 sudo[2882]:     core : PWD=/home/core ; USER=root ; COMMAND=/usr/sbin/ig run trace_exec:v0.50.0 --host --filter proc.comm=docker,args~ps --output json --verbose
Oct 19 14:34:08.713672 sudo[2882]: pam_unix(sudo:session): session opened for user root(uid=0) by core(uid=500)
Oct 19 14:34:15.536155 sshd[2649]: Connection closed by 20.76.155.168 port 32972
Oct 19 14:34:15.537866 sshd-session[2645]: pam_unix(sshd:session): session closed for user core
Oct 19 14:34:15.540264 systemd[1]: sshd@4-4097-10.0.0.23:22-20.76.155.168:32972.service: Deactivated successfully.
Oct 19 14:34:15.542137 systemd-logind[2241]: Session 8 logged out. Waiting for processes to exit.
Oct 19 14:34:15.557411 systemd[1]: Started sshd@5-4098-10.0.0.23:22-20.76.155.168:51426.service - OpenSSH per-connection server daemon (20.76.155.168:51426).
Oct 19 14:34:15.661563 sshd[2936]: Accepted publickey for core from 20.76.155.168 port 51426 ssh2: RSA SHA256:HrEdI9shwGH/Mm+9Dn9ES3Lg/10ptUsFo/5kSKgIZsM
Oct 19 14:34:15.662490 sshd-session[2936]: pam_unix(sshd:session): session opened for user core(uid=500) by core(uid=0)
Oct 19 14:34:15.666706 systemd-logind[2241]: New session '9' of user 'core' with class 'user' and type 'tty'.
Oct 19 14:34:15.675248 systemd[1]: Started session-9.scope - Session 9 of User core.
Oct 19 14:34:15.698655 sudo[2942]:     core : PWD=/home/core ; USER=root ; COMMAND=/usr/sbin/ig run trace_dns:v0.50.0 --help
Oct 19 14:34:15.698892 sudo[2942]: pam_unix(sudo:session): session opened for user root(uid=0) by core(uid=500)
Oct 19 14:34:19.019303 sudo[2942]: pam_unix(sudo:session): session closed for user root
Oct 19 14:34:19.026388 sudo[2952]:     core : PWD=/home/core ; USER=root ; COMMAND=/usr/sbin/ig run trace_dns:v0.50.0 --host --filter name=flatcar.org. --output json --verbose
Oct 19 14:34:19.026629 sudo[2952]: pam_unix(sudo:session): session opened for user root(uid=0) by core(uid=500)
Oct 19 14:34:19.783098 sshd[2940]: Connection closed by 20.76.155.168 port 51426
Oct 19 14:34:19.784801 sshd-session[2936]: pam_unix(sshd:session): session closed for user core
Oct 19 14:34:19.787175 systemd[1]: sshd@5-4098-10.0.0.23:22-20.76.155.168:51426.service: Deactivated successfully.
Oct 19 14:34:19.789825 systemd-logind[2241]: Session 9 logged out. Waiting for processes to exit.