Jun 25 16:30:57.014347 kernel: Linux version 6.1.95-flatcar (build@pony-truck.infra.kinvolk.io) (x86_64-cros-linux-gnu-gcc (Gentoo Hardened 13.2.1_p20230826 p7) 13.2.1 20230826, GNU ld (Gentoo 2.40 p5) 2.40.0) #1 SMP PREEMPT_DYNAMIC Tue Jun 25 13:16:37 -00 2024 Jun 25 16:30:57.021429 kernel: Command line: BOOT_IMAGE=/flatcar/vmlinuz-a mount.usr=/dev/mapper/usr verity.usr=PARTUUID=7130c94a-213a-4e5a-8e26-6cce9662f132 rootflags=rw mount.usrflags=ro consoleblank=0 root=LABEL=ROOT console=ttyS0,115200n8 console=tty0 flatcar.first_boot=detected flatcar.oem.id=openstack verity.usrhash=05dd62847a393595c8cf7409b58afa2d4045a2186c3cd58722296be6f3bc4fa9 Jun 25 16:30:57.021474 kernel: BIOS-provided physical RAM map: Jun 25 16:30:57.021491 kernel: BIOS-e820: [mem 0x0000000000000000-0x000000000009fbff] usable Jun 25 16:30:57.021507 kernel: BIOS-e820: [mem 0x000000000009fc00-0x000000000009ffff] reserved Jun 25 16:30:57.021523 kernel: BIOS-e820: [mem 0x00000000000f0000-0x00000000000fffff] reserved Jun 25 16:30:57.021542 kernel: BIOS-e820: [mem 0x0000000000100000-0x000000007ffdcfff] usable Jun 25 16:30:57.021559 kernel: BIOS-e820: [mem 0x000000007ffdd000-0x000000007fffffff] reserved Jun 25 16:30:57.021576 kernel: BIOS-e820: [mem 0x00000000feffc000-0x00000000feffffff] reserved Jun 25 16:30:57.021595 kernel: BIOS-e820: [mem 0x00000000fffc0000-0x00000000ffffffff] reserved Jun 25 16:30:57.021612 kernel: NX (Execute Disable) protection: active Jun 25 16:30:57.021628 kernel: SMBIOS 2.8 present. Jun 25 16:30:57.021645 kernel: DMI: OpenStack Foundation OpenStack Nova, BIOS 1.15.0-1 04/01/2014 Jun 25 16:30:57.021661 kernel: Hypervisor detected: KVM Jun 25 16:30:57.021681 kernel: kvm-clock: Using msrs 4b564d01 and 4b564d00 Jun 25 16:30:57.021702 kernel: kvm-clock: using sched offset of 11123062089 cycles Jun 25 16:30:57.021721 kernel: clocksource: kvm-clock: mask: 0xffffffffffffffff max_cycles: 0x1cd42e4dffb, max_idle_ns: 881590591483 ns Jun 25 16:30:57.021739 kernel: tsc: Detected 1996.249 MHz processor Jun 25 16:30:57.021758 kernel: e820: update [mem 0x00000000-0x00000fff] usable ==> reserved Jun 25 16:30:57.021777 kernel: e820: remove [mem 0x000a0000-0x000fffff] usable Jun 25 16:30:57.021795 kernel: last_pfn = 0x7ffdd max_arch_pfn = 0x400000000 Jun 25 16:30:57.021813 kernel: x86/PAT: Configuration [0-7]: WB WC UC- UC WB WP UC- WT Jun 25 16:30:57.021830 kernel: ACPI: Early table checksum verification disabled Jun 25 16:30:57.021848 kernel: ACPI: RSDP 0x00000000000F5930 000014 (v00 BOCHS ) Jun 25 16:30:57.021870 kernel: ACPI: RSDT 0x000000007FFE1848 000030 (v01 BOCHS BXPC 00000001 BXPC 00000001) Jun 25 16:30:57.021888 kernel: ACPI: FACP 0x000000007FFE172C 000074 (v01 BOCHS BXPC 00000001 BXPC 00000001) Jun 25 16:30:57.021906 kernel: ACPI: DSDT 0x000000007FFE0040 0016EC (v01 BOCHS BXPC 00000001 BXPC 00000001) Jun 25 16:30:57.021923 kernel: ACPI: FACS 0x000000007FFE0000 000040 Jun 25 16:30:57.021941 kernel: ACPI: APIC 0x000000007FFE17A0 000080 (v01 BOCHS BXPC 00000001 BXPC 00000001) Jun 25 16:30:57.021959 kernel: ACPI: WAET 0x000000007FFE1820 000028 (v01 BOCHS BXPC 00000001 BXPC 00000001) Jun 25 16:30:57.021976 kernel: ACPI: Reserving FACP table memory at [mem 0x7ffe172c-0x7ffe179f] Jun 25 16:30:57.021994 kernel: ACPI: Reserving DSDT table memory at [mem 0x7ffe0040-0x7ffe172b] Jun 25 16:30:57.022015 kernel: ACPI: Reserving FACS table memory at [mem 0x7ffe0000-0x7ffe003f] Jun 25 16:30:57.022032 kernel: ACPI: Reserving APIC table memory at [mem 0x7ffe17a0-0x7ffe181f] Jun 25 16:30:57.022050 kernel: ACPI: Reserving WAET table memory at [mem 0x7ffe1820-0x7ffe1847] Jun 25 16:30:57.022067 kernel: No NUMA configuration found Jun 25 16:30:57.022084 kernel: Faking a node at [mem 0x0000000000000000-0x000000007ffdcfff] Jun 25 16:30:57.022102 kernel: NODE_DATA(0) allocated [mem 0x7ffd7000-0x7ffdcfff] Jun 25 16:30:57.022119 kernel: Zone ranges: Jun 25 16:30:57.022137 kernel: DMA [mem 0x0000000000001000-0x0000000000ffffff] Jun 25 16:30:57.022162 kernel: DMA32 [mem 0x0000000001000000-0x000000007ffdcfff] Jun 25 16:30:57.022183 kernel: Normal empty Jun 25 16:30:57.022201 kernel: Movable zone start for each node Jun 25 16:30:57.022219 kernel: Early memory node ranges Jun 25 16:30:57.022238 kernel: node 0: [mem 0x0000000000001000-0x000000000009efff] Jun 25 16:30:57.022256 kernel: node 0: [mem 0x0000000000100000-0x000000007ffdcfff] Jun 25 16:30:57.022275 kernel: Initmem setup node 0 [mem 0x0000000000001000-0x000000007ffdcfff] Jun 25 16:30:57.022296 kernel: On node 0, zone DMA: 1 pages in unavailable ranges Jun 25 16:30:57.022315 kernel: On node 0, zone DMA: 97 pages in unavailable ranges Jun 25 16:30:57.022333 kernel: On node 0, zone DMA32: 35 pages in unavailable ranges Jun 25 16:30:57.022351 kernel: ACPI: PM-Timer IO Port: 0x608 Jun 25 16:30:57.022369 kernel: ACPI: LAPIC_NMI (acpi_id[0xff] dfl dfl lint[0x1]) Jun 25 16:30:57.022419 kernel: IOAPIC[0]: apic_id 0, version 17, address 0xfec00000, GSI 0-23 Jun 25 16:30:57.022439 kernel: ACPI: INT_SRC_OVR (bus 0 bus_irq 0 global_irq 2 dfl dfl) Jun 25 16:30:57.022457 kernel: ACPI: INT_SRC_OVR (bus 0 bus_irq 5 global_irq 5 high level) Jun 25 16:30:57.022476 kernel: ACPI: INT_SRC_OVR (bus 0 bus_irq 9 global_irq 9 high level) Jun 25 16:30:57.022498 kernel: ACPI: INT_SRC_OVR (bus 0 bus_irq 10 global_irq 10 high level) Jun 25 16:30:57.022517 kernel: ACPI: INT_SRC_OVR (bus 0 bus_irq 11 global_irq 11 high level) Jun 25 16:30:57.022535 kernel: ACPI: Using ACPI (MADT) for SMP configuration information Jun 25 16:30:57.022553 kernel: smpboot: Allowing 2 CPUs, 0 hotplug CPUs Jun 25 16:30:57.022572 kernel: [mem 0x80000000-0xfeffbfff] available for PCI devices Jun 25 16:30:57.022590 kernel: Booting paravirtualized kernel on KVM Jun 25 16:30:57.022609 kernel: clocksource: refined-jiffies: mask: 0xffffffff max_cycles: 0xffffffff, max_idle_ns: 1910969940391419 ns Jun 25 16:30:57.022628 kernel: setup_percpu: NR_CPUS:512 nr_cpumask_bits:2 nr_cpu_ids:2 nr_node_ids:1 Jun 25 16:30:57.022647 kernel: percpu: Embedded 57 pages/cpu s194792 r8192 d30488 u1048576 Jun 25 16:30:57.022669 kernel: pcpu-alloc: s194792 r8192 d30488 u1048576 alloc=1*2097152 Jun 25 16:30:57.022687 kernel: pcpu-alloc: [0] 0 1 Jun 25 16:30:57.022705 kernel: kvm-guest: PV spinlocks disabled, no host support Jun 25 16:30:57.022723 kernel: Fallback order for Node 0: 0 Jun 25 16:30:57.022742 kernel: Built 1 zonelists, mobility grouping on. Total pages: 515805 Jun 25 16:30:57.022760 kernel: Policy zone: DMA32 Jun 25 16:30:57.022782 kernel: Kernel command line: rootflags=rw mount.usrflags=ro BOOT_IMAGE=/flatcar/vmlinuz-a mount.usr=/dev/mapper/usr verity.usr=PARTUUID=7130c94a-213a-4e5a-8e26-6cce9662f132 rootflags=rw mount.usrflags=ro consoleblank=0 root=LABEL=ROOT console=ttyS0,115200n8 console=tty0 flatcar.first_boot=detected flatcar.oem.id=openstack verity.usrhash=05dd62847a393595c8cf7409b58afa2d4045a2186c3cd58722296be6f3bc4fa9 Jun 25 16:30:57.022802 kernel: Unknown kernel command line parameters "BOOT_IMAGE=/flatcar/vmlinuz-a", will be passed to user space. Jun 25 16:30:57.022824 kernel: Dentry cache hash table entries: 262144 (order: 9, 2097152 bytes, linear) Jun 25 16:30:57.022842 kernel: Inode-cache hash table entries: 131072 (order: 8, 1048576 bytes, linear) Jun 25 16:30:57.022861 kernel: mem auto-init: stack:off, heap alloc:off, heap free:off Jun 25 16:30:57.022880 kernel: Memory: 1967132K/2096620K available (12293K kernel code, 2301K rwdata, 19992K rodata, 47156K init, 4308K bss, 129228K reserved, 0K cma-reserved) Jun 25 16:30:57.022899 kernel: SLUB: HWalign=64, Order=0-3, MinObjects=0, CPUs=2, Nodes=1 Jun 25 16:30:57.022917 kernel: ftrace: allocating 36080 entries in 141 pages Jun 25 16:30:57.022936 kernel: ftrace: allocated 141 pages with 4 groups Jun 25 16:30:57.022954 kernel: Dynamic Preempt: voluntary Jun 25 16:30:57.022972 kernel: rcu: Preemptible hierarchical RCU implementation. Jun 25 16:30:57.022995 kernel: rcu: RCU event tracing is enabled. Jun 25 16:30:57.023015 kernel: rcu: RCU restricting CPUs from NR_CPUS=512 to nr_cpu_ids=2. Jun 25 16:30:57.023034 kernel: Trampoline variant of Tasks RCU enabled. Jun 25 16:30:57.023053 kernel: Rude variant of Tasks RCU enabled. Jun 25 16:30:57.023072 kernel: Tracing variant of Tasks RCU enabled. Jun 25 16:30:57.023091 kernel: rcu: RCU calculated value of scheduler-enlistment delay is 100 jiffies. Jun 25 16:30:57.023109 kernel: rcu: Adjusting geometry for rcu_fanout_leaf=16, nr_cpu_ids=2 Jun 25 16:30:57.023127 kernel: NR_IRQS: 33024, nr_irqs: 440, preallocated irqs: 16 Jun 25 16:30:57.023146 kernel: rcu: srcu_init: Setting srcu_struct sizes based on contention. Jun 25 16:30:57.023164 kernel: Console: colour VGA+ 80x25 Jun 25 16:30:57.023186 kernel: printk: console [tty0] enabled Jun 25 16:30:57.023204 kernel: printk: console [ttyS0] enabled Jun 25 16:30:57.023222 kernel: ACPI: Core revision 20220331 Jun 25 16:30:57.023241 kernel: APIC: Switch to symmetric I/O mode setup Jun 25 16:30:57.023259 kernel: x2apic enabled Jun 25 16:30:57.023277 kernel: Switched APIC routing to physical x2apic. Jun 25 16:30:57.023296 kernel: ..TIMER: vector=0x30 apic1=0 pin1=2 apic2=-1 pin2=-1 Jun 25 16:30:57.023314 kernel: tsc: Marking TSC unstable due to TSCs unsynchronized Jun 25 16:30:57.023334 kernel: Calibrating delay loop (skipped) preset value.. 3992.49 BogoMIPS (lpj=1996249) Jun 25 16:30:57.023356 kernel: Last level iTLB entries: 4KB 0, 2MB 0, 4MB 0 Jun 25 16:30:57.023375 kernel: Last level dTLB entries: 4KB 0, 2MB 0, 4MB 0, 1GB 0 Jun 25 16:30:57.023417 kernel: Spectre V1 : Mitigation: usercopy/swapgs barriers and __user pointer sanitization Jun 25 16:30:57.023437 kernel: Spectre V2 : Mitigation: Retpolines Jun 25 16:30:57.023455 kernel: Spectre V2 : Spectre v2 / SpectreRSB mitigation: Filling RSB on context switch Jun 25 16:30:57.023474 kernel: Spectre V2 : Spectre v2 / SpectreRSB : Filling RSB on VMEXIT Jun 25 16:30:57.023492 kernel: Speculative Store Bypass: Vulnerable Jun 25 16:30:57.023511 kernel: x86/fpu: x87 FPU will use FXSAVE Jun 25 16:30:57.023529 kernel: Freeing SMP alternatives memory: 32K Jun 25 16:30:57.023551 kernel: pid_max: default: 32768 minimum: 301 Jun 25 16:30:57.023570 kernel: LSM: Security Framework initializing Jun 25 16:30:57.023588 kernel: SELinux: Initializing. Jun 25 16:30:57.023606 kernel: Mount-cache hash table entries: 4096 (order: 3, 32768 bytes, linear) Jun 25 16:30:57.023625 kernel: Mountpoint-cache hash table entries: 4096 (order: 3, 32768 bytes, linear) Jun 25 16:30:57.023644 kernel: smpboot: CPU0: AMD Intel Core i7 9xx (Nehalem Class Core i7) (family: 0x6, model: 0x1a, stepping: 0x3) Jun 25 16:30:57.023663 kernel: cblist_init_generic: Setting adjustable number of callback queues. Jun 25 16:30:57.023682 kernel: cblist_init_generic: Setting shift to 1 and lim to 1. Jun 25 16:30:57.023714 kernel: cblist_init_generic: Setting adjustable number of callback queues. Jun 25 16:30:57.023734 kernel: cblist_init_generic: Setting shift to 1 and lim to 1. Jun 25 16:30:57.023753 kernel: cblist_init_generic: Setting adjustable number of callback queues. Jun 25 16:30:57.023772 kernel: cblist_init_generic: Setting shift to 1 and lim to 1. Jun 25 16:30:57.023794 kernel: Performance Events: AMD PMU driver. Jun 25 16:30:57.023813 kernel: ... version: 0 Jun 25 16:30:57.023832 kernel: ... bit width: 48 Jun 25 16:30:57.023853 kernel: ... generic registers: 4 Jun 25 16:30:57.023873 kernel: ... value mask: 0000ffffffffffff Jun 25 16:30:57.023896 kernel: ... max period: 00007fffffffffff Jun 25 16:30:57.023915 kernel: ... fixed-purpose events: 0 Jun 25 16:30:57.023935 kernel: ... event mask: 000000000000000f Jun 25 16:30:57.023955 kernel: signal: max sigframe size: 1440 Jun 25 16:30:57.023974 kernel: rcu: Hierarchical SRCU implementation. Jun 25 16:30:57.023994 kernel: rcu: Max phase no-delay instances is 400. Jun 25 16:30:57.024013 kernel: smp: Bringing up secondary CPUs ... Jun 25 16:30:57.024032 kernel: x86: Booting SMP configuration: Jun 25 16:30:57.024051 kernel: .... node #0, CPUs: #1 Jun 25 16:30:57.024071 kernel: smp: Brought up 1 node, 2 CPUs Jun 25 16:30:57.024094 kernel: smpboot: Max logical packages: 2 Jun 25 16:30:57.024113 kernel: smpboot: Total of 2 processors activated (7984.99 BogoMIPS) Jun 25 16:30:57.024133 kernel: devtmpfs: initialized Jun 25 16:30:57.024152 kernel: x86/mm: Memory block size: 128MB Jun 25 16:30:57.024172 kernel: clocksource: jiffies: mask: 0xffffffff max_cycles: 0xffffffff, max_idle_ns: 1911260446275000 ns Jun 25 16:30:57.024192 kernel: futex hash table entries: 512 (order: 3, 32768 bytes, linear) Jun 25 16:30:57.024211 kernel: pinctrl core: initialized pinctrl subsystem Jun 25 16:30:57.024231 kernel: NET: Registered PF_NETLINK/PF_ROUTE protocol family Jun 25 16:30:57.024251 kernel: audit: initializing netlink subsys (disabled) Jun 25 16:30:57.024274 kernel: audit: type=2000 audit(1719333055.724:1): state=initialized audit_enabled=0 res=1 Jun 25 16:30:57.024294 kernel: thermal_sys: Registered thermal governor 'step_wise' Jun 25 16:30:57.024313 kernel: thermal_sys: Registered thermal governor 'user_space' Jun 25 16:30:57.024333 kernel: cpuidle: using governor menu Jun 25 16:30:57.024352 kernel: acpiphp: ACPI Hot Plug PCI Controller Driver version: 0.5 Jun 25 16:30:57.024372 kernel: dca service started, version 1.12.1 Jun 25 16:30:57.024414 kernel: PCI: Using configuration type 1 for base access Jun 25 16:30:57.024435 kernel: kprobes: kprobe jump-optimization is enabled. All kprobes are optimized if possible. Jun 25 16:30:57.024454 kernel: HugeTLB: registered 2.00 MiB page size, pre-allocated 0 pages Jun 25 16:30:57.024478 kernel: HugeTLB: 28 KiB vmemmap can be freed for a 2.00 MiB page Jun 25 16:30:57.024498 kernel: ACPI: Added _OSI(Module Device) Jun 25 16:30:57.024517 kernel: ACPI: Added _OSI(Processor Device) Jun 25 16:30:57.024536 kernel: ACPI: Added _OSI(3.0 _SCP Extensions) Jun 25 16:30:57.024556 kernel: ACPI: Added _OSI(Processor Aggregator Device) Jun 25 16:30:57.024575 kernel: ACPI: 1 ACPI AML tables successfully acquired and loaded Jun 25 16:30:57.024594 kernel: ACPI: Interpreter enabled Jun 25 16:30:57.024614 kernel: ACPI: PM: (supports S0 S3 S5) Jun 25 16:30:57.024633 kernel: ACPI: Using IOAPIC for interrupt routing Jun 25 16:30:57.024656 kernel: PCI: Using host bridge windows from ACPI; if necessary, use "pci=nocrs" and report a bug Jun 25 16:30:57.024676 kernel: PCI: Using E820 reservations for host bridge windows Jun 25 16:30:57.024695 kernel: ACPI: Enabled 2 GPEs in block 00 to 0F Jun 25 16:30:57.024714 kernel: ACPI: PCI Root Bridge [PCI0] (domain 0000 [bus 00-ff]) Jun 25 16:30:57.025033 kernel: acpi PNP0A03:00: _OSC: OS supports [ASPM ClockPM Segments MSI HPX-Type3] Jun 25 16:30:57.025255 kernel: acpi PNP0A03:00: _OSC: not requesting OS control; OS requires [ExtendedConfig ASPM ClockPM MSI] Jun 25 16:30:57.025515 kernel: acpi PNP0A03:00: fail to add MMCONFIG information, can't access extended PCI configuration space under this bridge. Jun 25 16:30:57.025556 kernel: acpiphp: Slot [3] registered Jun 25 16:30:57.025577 kernel: acpiphp: Slot [4] registered Jun 25 16:30:57.025597 kernel: acpiphp: Slot [5] registered Jun 25 16:30:57.025616 kernel: acpiphp: Slot [6] registered Jun 25 16:30:57.025635 kernel: acpiphp: Slot [7] registered Jun 25 16:30:57.025655 kernel: acpiphp: Slot [8] registered Jun 25 16:30:57.025674 kernel: acpiphp: Slot [9] registered Jun 25 16:30:57.025693 kernel: acpiphp: Slot [10] registered Jun 25 16:30:57.025712 kernel: acpiphp: Slot [11] registered Jun 25 16:30:57.025735 kernel: acpiphp: Slot [12] registered Jun 25 16:30:57.025754 kernel: acpiphp: Slot [13] registered Jun 25 16:30:57.025773 kernel: acpiphp: Slot [14] registered Jun 25 16:30:57.025792 kernel: acpiphp: Slot [15] registered Jun 25 16:30:57.025811 kernel: acpiphp: Slot [16] registered Jun 25 16:30:57.025830 kernel: acpiphp: Slot [17] registered Jun 25 16:30:57.025849 kernel: acpiphp: Slot [18] registered Jun 25 16:30:57.025868 kernel: acpiphp: Slot [19] registered Jun 25 16:30:57.025887 kernel: acpiphp: Slot [20] registered Jun 25 16:30:57.025906 kernel: acpiphp: Slot [21] registered Jun 25 16:30:57.025929 kernel: acpiphp: Slot [22] registered Jun 25 16:30:57.025948 kernel: acpiphp: Slot [23] registered Jun 25 16:30:57.025967 kernel: acpiphp: Slot [24] registered Jun 25 16:30:57.025986 kernel: acpiphp: Slot [25] registered Jun 25 16:30:57.026005 kernel: acpiphp: Slot [26] registered Jun 25 16:30:57.026024 kernel: acpiphp: Slot [27] registered Jun 25 16:30:57.026043 kernel: acpiphp: Slot [28] registered Jun 25 16:30:57.026062 kernel: acpiphp: Slot [29] registered Jun 25 16:30:57.026082 kernel: acpiphp: Slot [30] registered Jun 25 16:30:57.026104 kernel: acpiphp: Slot [31] registered Jun 25 16:30:57.026123 kernel: PCI host bridge to bus 0000:00 Jun 25 16:30:57.026329 kernel: pci_bus 0000:00: root bus resource [io 0x0000-0x0cf7 window] Jun 25 16:30:57.026574 kernel: pci_bus 0000:00: root bus resource [io 0x0d00-0xffff window] Jun 25 16:30:57.026765 kernel: pci_bus 0000:00: root bus resource [mem 0x000a0000-0x000bffff window] Jun 25 16:30:57.026944 kernel: pci_bus 0000:00: root bus resource [mem 0x80000000-0xfebfffff window] Jun 25 16:30:57.027127 kernel: pci_bus 0000:00: root bus resource [mem 0x100000000-0x17fffffff window] Jun 25 16:30:57.027309 kernel: pci_bus 0000:00: root bus resource [bus 00-ff] Jun 25 16:30:57.027601 kernel: pci 0000:00:00.0: [8086:1237] type 00 class 0x060000 Jun 25 16:30:57.027882 kernel: pci 0000:00:01.0: [8086:7000] type 00 class 0x060100 Jun 25 16:30:57.028126 kernel: pci 0000:00:01.1: [8086:7010] type 00 class 0x010180 Jun 25 16:30:57.028341 kernel: pci 0000:00:01.1: reg 0x20: [io 0xc120-0xc12f] Jun 25 16:30:57.028603 kernel: pci 0000:00:01.1: legacy IDE quirk: reg 0x10: [io 0x01f0-0x01f7] Jun 25 16:30:57.028815 kernel: pci 0000:00:01.1: legacy IDE quirk: reg 0x14: [io 0x03f6] Jun 25 16:30:57.029069 kernel: pci 0000:00:01.1: legacy IDE quirk: reg 0x18: [io 0x0170-0x0177] Jun 25 16:30:57.029283 kernel: pci 0000:00:01.1: legacy IDE quirk: reg 0x1c: [io 0x0376] Jun 25 16:30:57.029547 kernel: pci 0000:00:01.3: [8086:7113] type 00 class 0x068000 Jun 25 16:30:57.029763 kernel: pci 0000:00:01.3: quirk: [io 0x0600-0x063f] claimed by PIIX4 ACPI Jun 25 16:30:57.029970 kernel: pci 0000:00:01.3: quirk: [io 0x0700-0x070f] claimed by PIIX4 SMB Jun 25 16:30:57.030201 kernel: pci 0000:00:02.0: [1af4:1050] type 00 class 0x030000 Jun 25 16:30:57.030463 kernel: pci 0000:00:02.0: reg 0x10: [mem 0xfe000000-0xfe7fffff pref] Jun 25 16:30:57.030682 kernel: pci 0000:00:02.0: reg 0x18: [mem 0xfe800000-0xfe803fff 64bit pref] Jun 25 16:30:57.030893 kernel: pci 0000:00:02.0: reg 0x20: [mem 0xfeb90000-0xfeb90fff] Jun 25 16:30:57.031118 kernel: pci 0000:00:02.0: reg 0x30: [mem 0xfeb80000-0xfeb8ffff pref] Jun 25 16:30:57.031333 kernel: pci 0000:00:02.0: Video device with shadowed ROM at [mem 0x000c0000-0x000dffff] Jun 25 16:30:57.031602 kernel: pci 0000:00:03.0: [1af4:1000] type 00 class 0x020000 Jun 25 16:30:57.031823 kernel: pci 0000:00:03.0: reg 0x10: [io 0xc080-0xc0bf] Jun 25 16:30:57.032045 kernel: pci 0000:00:03.0: reg 0x14: [mem 0xfeb91000-0xfeb91fff] Jun 25 16:30:57.032252 kernel: pci 0000:00:03.0: reg 0x20: [mem 0xfe804000-0xfe807fff 64bit pref] Jun 25 16:30:57.032523 kernel: pci 0000:00:03.0: reg 0x30: [mem 0xfeb00000-0xfeb7ffff pref] Jun 25 16:30:57.032748 kernel: pci 0000:00:04.0: [1af4:1001] type 00 class 0x010000 Jun 25 16:30:57.032959 kernel: pci 0000:00:04.0: reg 0x10: [io 0xc000-0xc07f] Jun 25 16:30:57.033195 kernel: pci 0000:00:04.0: reg 0x14: [mem 0xfeb92000-0xfeb92fff] Jun 25 16:30:57.033451 kernel: pci 0000:00:04.0: reg 0x20: [mem 0xfe808000-0xfe80bfff 64bit pref] Jun 25 16:30:57.033715 kernel: pci 0000:00:05.0: [1af4:1002] type 00 class 0x00ff00 Jun 25 16:30:57.033929 kernel: pci 0000:00:05.0: reg 0x10: [io 0xc0c0-0xc0ff] Jun 25 16:30:57.034138 kernel: pci 0000:00:05.0: reg 0x20: [mem 0xfe80c000-0xfe80ffff 64bit pref] Jun 25 16:30:57.034499 kernel: pci 0000:00:06.0: [1af4:1005] type 00 class 0x00ff00 Jun 25 16:30:57.034725 kernel: pci 0000:00:06.0: reg 0x10: [io 0xc100-0xc11f] Jun 25 16:30:57.034930 kernel: pci 0000:00:06.0: reg 0x20: [mem 0xfe810000-0xfe813fff 64bit pref] Jun 25 16:30:57.034960 kernel: ACPI: PCI: Interrupt link LNKA configured for IRQ 10 Jun 25 16:30:57.034989 kernel: ACPI: PCI: Interrupt link LNKB configured for IRQ 10 Jun 25 16:30:57.035010 kernel: ACPI: PCI: Interrupt link LNKC configured for IRQ 11 Jun 25 16:30:57.035029 kernel: ACPI: PCI: Interrupt link LNKD configured for IRQ 11 Jun 25 16:30:57.035049 kernel: ACPI: PCI: Interrupt link LNKS configured for IRQ 9 Jun 25 16:30:57.035069 kernel: iommu: Default domain type: Translated Jun 25 16:30:57.035089 kernel: iommu: DMA domain TLB invalidation policy: lazy mode Jun 25 16:30:57.035108 kernel: pps_core: LinuxPPS API ver. 1 registered Jun 25 16:30:57.035129 kernel: pps_core: Software ver. 5.3.6 - Copyright 2005-2007 Rodolfo Giometti Jun 25 16:30:57.035149 kernel: PTP clock support registered Jun 25 16:30:57.035172 kernel: PCI: Using ACPI for IRQ routing Jun 25 16:30:57.035192 kernel: PCI: pci_cache_line_size set to 64 bytes Jun 25 16:30:57.035211 kernel: e820: reserve RAM buffer [mem 0x0009fc00-0x0009ffff] Jun 25 16:30:57.035231 kernel: e820: reserve RAM buffer [mem 0x7ffdd000-0x7fffffff] Jun 25 16:30:57.035490 kernel: pci 0000:00:02.0: vgaarb: setting as boot VGA device Jun 25 16:30:57.035705 kernel: pci 0000:00:02.0: vgaarb: bridge control possible Jun 25 16:30:57.035910 kernel: pci 0000:00:02.0: vgaarb: VGA device added: decodes=io+mem,owns=io+mem,locks=none Jun 25 16:30:57.035939 kernel: vgaarb: loaded Jun 25 16:30:57.035959 kernel: clocksource: Switched to clocksource kvm-clock Jun 25 16:30:57.035987 kernel: VFS: Disk quotas dquot_6.6.0 Jun 25 16:30:57.036007 kernel: VFS: Dquot-cache hash table entries: 512 (order 0, 4096 bytes) Jun 25 16:30:57.036027 kernel: pnp: PnP ACPI init Jun 25 16:30:57.036237 kernel: pnp 00:03: [dma 2] Jun 25 16:30:57.036269 kernel: pnp: PnP ACPI: found 5 devices Jun 25 16:30:57.036290 kernel: clocksource: acpi_pm: mask: 0xffffff max_cycles: 0xffffff, max_idle_ns: 2085701024 ns Jun 25 16:30:57.036310 kernel: NET: Registered PF_INET protocol family Jun 25 16:30:57.036329 kernel: IP idents hash table entries: 32768 (order: 6, 262144 bytes, linear) Jun 25 16:30:57.036354 kernel: tcp_listen_portaddr_hash hash table entries: 1024 (order: 2, 16384 bytes, linear) Jun 25 16:30:57.036375 kernel: Table-perturb hash table entries: 65536 (order: 6, 262144 bytes, linear) Jun 25 16:30:57.036514 kernel: TCP established hash table entries: 16384 (order: 5, 131072 bytes, linear) Jun 25 16:30:57.036536 kernel: TCP bind hash table entries: 16384 (order: 7, 524288 bytes, linear) Jun 25 16:30:57.036556 kernel: TCP: Hash tables configured (established 16384 bind 16384) Jun 25 16:30:57.036575 kernel: UDP hash table entries: 1024 (order: 3, 32768 bytes, linear) Jun 25 16:30:57.036595 kernel: UDP-Lite hash table entries: 1024 (order: 3, 32768 bytes, linear) Jun 25 16:30:57.036615 kernel: NET: Registered PF_UNIX/PF_LOCAL protocol family Jun 25 16:30:57.036634 kernel: NET: Registered PF_XDP protocol family Jun 25 16:30:57.036834 kernel: pci_bus 0000:00: resource 4 [io 0x0000-0x0cf7 window] Jun 25 16:30:57.037040 kernel: pci_bus 0000:00: resource 5 [io 0x0d00-0xffff window] Jun 25 16:30:57.037227 kernel: pci_bus 0000:00: resource 6 [mem 0x000a0000-0x000bffff window] Jun 25 16:30:57.037470 kernel: pci_bus 0000:00: resource 7 [mem 0x80000000-0xfebfffff window] Jun 25 16:30:57.037666 kernel: pci_bus 0000:00: resource 8 [mem 0x100000000-0x17fffffff window] Jun 25 16:30:57.037877 kernel: pci 0000:00:01.0: PIIX3: Enabling Passive Release Jun 25 16:30:57.038085 kernel: pci 0000:00:00.0: Limiting direct PCI/PCI transfers Jun 25 16:30:57.038115 kernel: PCI: CLS 0 bytes, default 64 Jun 25 16:30:57.038143 kernel: Initialise system trusted keyrings Jun 25 16:30:57.038163 kernel: workingset: timestamp_bits=39 max_order=19 bucket_order=0 Jun 25 16:30:57.038183 kernel: Key type asymmetric registered Jun 25 16:30:57.038203 kernel: Asymmetric key parser 'x509' registered Jun 25 16:30:57.038223 kernel: alg: self-tests for CTR-KDF (hmac(sha256)) passed Jun 25 16:30:57.038243 kernel: Block layer SCSI generic (bsg) driver version 0.4 loaded (major 249) Jun 25 16:30:57.038263 kernel: io scheduler mq-deadline registered Jun 25 16:30:57.038282 kernel: io scheduler kyber registered Jun 25 16:30:57.038301 kernel: io scheduler bfq registered Jun 25 16:30:57.038325 kernel: ioatdma: Intel(R) QuickData Technology Driver 5.00 Jun 25 16:30:57.038346 kernel: ACPI: \_SB_.LNKB: Enabled at IRQ 10 Jun 25 16:30:57.038366 kernel: ACPI: \_SB_.LNKC: Enabled at IRQ 11 Jun 25 16:30:57.038427 kernel: ACPI: \_SB_.LNKD: Enabled at IRQ 11 Jun 25 16:30:57.038449 kernel: ACPI: \_SB_.LNKA: Enabled at IRQ 10 Jun 25 16:30:57.038469 kernel: Serial: 8250/16550 driver, 4 ports, IRQ sharing enabled Jun 25 16:30:57.038488 kernel: 00:00: ttyS0 at I/O 0x3f8 (irq = 4, base_baud = 115200) is a 16550A Jun 25 16:30:57.038508 kernel: random: crng init done Jun 25 16:30:57.038528 kernel: i8042: PNP: PS/2 Controller [PNP0303:KBD,PNP0f13:MOU] at 0x60,0x64 irq 1,12 Jun 25 16:30:57.038552 kernel: serio: i8042 KBD port at 0x60,0x64 irq 1 Jun 25 16:30:57.038572 kernel: serio: i8042 AUX port at 0x60,0x64 irq 12 Jun 25 16:30:57.038914 kernel: rtc_cmos 00:04: RTC can wake from S4 Jun 25 16:30:57.038950 kernel: input: AT Translated Set 2 keyboard as /devices/platform/i8042/serio0/input/input0 Jun 25 16:30:57.039134 kernel: rtc_cmos 00:04: registered as rtc0 Jun 25 16:30:57.039324 kernel: rtc_cmos 00:04: setting system clock to 2024-06-25T16:30:56 UTC (1719333056) Jun 25 16:30:57.039564 kernel: rtc_cmos 00:04: alarms up to one day, y3k, 242 bytes nvram Jun 25 16:30:57.039597 kernel: NET: Registered PF_INET6 protocol family Jun 25 16:30:57.039626 kernel: Segment Routing with IPv6 Jun 25 16:30:57.039645 kernel: In-situ OAM (IOAM) with IPv6 Jun 25 16:30:57.039665 kernel: NET: Registered PF_PACKET protocol family Jun 25 16:30:57.039686 kernel: Key type dns_resolver registered Jun 25 16:30:57.039705 kernel: IPI shorthand broadcast: enabled Jun 25 16:30:57.039725 kernel: sched_clock: Marking stable (900046802, 124914384)->(1029674464, -4713278) Jun 25 16:30:57.039744 kernel: registered taskstats version 1 Jun 25 16:30:57.039764 kernel: Loading compiled-in X.509 certificates Jun 25 16:30:57.039783 kernel: Loaded X.509 cert 'Kinvolk GmbH: Module signing key for 6.1.95-flatcar: c37bb6ef57220bb1c07535cfcaa08c84d806a137' Jun 25 16:30:57.039806 kernel: Key type .fscrypt registered Jun 25 16:30:57.039826 kernel: Key type fscrypt-provisioning registered Jun 25 16:30:57.039845 kernel: ima: No TPM chip found, activating TPM-bypass! Jun 25 16:30:57.039866 kernel: ima: Allocated hash algorithm: sha1 Jun 25 16:30:57.039885 kernel: ima: No architecture policies found Jun 25 16:30:57.039905 kernel: clk: Disabling unused clocks Jun 25 16:30:57.039924 kernel: Freeing unused kernel image (initmem) memory: 47156K Jun 25 16:30:57.039944 kernel: Write protecting the kernel read-only data: 34816k Jun 25 16:30:57.039963 kernel: Freeing unused kernel image (text/rodata gap) memory: 2040K Jun 25 16:30:57.039987 kernel: Freeing unused kernel image (rodata/data gap) memory: 488K Jun 25 16:30:57.040006 kernel: Run /init as init process Jun 25 16:30:57.040026 kernel: with arguments: Jun 25 16:30:57.040045 kernel: /init Jun 25 16:30:57.040064 kernel: with environment: Jun 25 16:30:57.040083 kernel: HOME=/ Jun 25 16:30:57.040102 kernel: TERM=linux Jun 25 16:30:57.040121 kernel: BOOT_IMAGE=/flatcar/vmlinuz-a Jun 25 16:30:57.040147 systemd[1]: systemd 252 running in system mode (+PAM +AUDIT +SELINUX -APPARMOR +IMA +SMACK +SECCOMP +GCRYPT -GNUTLS +OPENSSL -ACL +BLKID +CURL +ELFUTILS -FIDO2 +IDN2 -IDN +IPTC +KMOD +LIBCRYPTSETUP +LIBFDISK +PCRE2 -PWQUALITY -P11KIT -QRENCODE -TPM2 +BZIP2 +LZ4 +XZ +ZLIB +ZSTD -BPF_FRAMEWORK -XKBCOMMON +UTMP +SYSVINIT default-hierarchy=unified) Jun 25 16:30:57.040177 systemd[1]: Detected virtualization kvm. Jun 25 16:30:57.040199 systemd[1]: Detected architecture x86-64. Jun 25 16:30:57.040221 systemd[1]: Running in initrd. Jun 25 16:30:57.040242 systemd[1]: No hostname configured, using default hostname. Jun 25 16:30:57.040263 systemd[1]: Hostname set to . Jun 25 16:30:57.040285 systemd[1]: Initializing machine ID from VM UUID. Jun 25 16:30:57.040310 systemd[1]: Queued start job for default target initrd.target. Jun 25 16:30:57.040331 systemd[1]: Started systemd-ask-password-console.path - Dispatch Password Requests to Console Directory Watch. Jun 25 16:30:57.040353 systemd[1]: Reached target cryptsetup.target - Local Encrypted Volumes. Jun 25 16:30:57.040374 systemd[1]: Reached target paths.target - Path Units. Jun 25 16:30:57.040436 systemd[1]: Reached target slices.target - Slice Units. Jun 25 16:30:57.040458 systemd[1]: Reached target swap.target - Swaps. Jun 25 16:30:57.040478 systemd[1]: Reached target timers.target - Timer Units. Jun 25 16:30:57.040501 systemd[1]: Listening on iscsid.socket - Open-iSCSI iscsid Socket. Jun 25 16:30:57.040527 systemd[1]: Listening on iscsiuio.socket - Open-iSCSI iscsiuio Socket. Jun 25 16:30:57.040549 systemd[1]: Listening on systemd-journald-audit.socket - Journal Audit Socket. Jun 25 16:30:57.040587 systemd[1]: Listening on systemd-journald-dev-log.socket - Journal Socket (/dev/log). Jun 25 16:30:57.040613 systemd[1]: Listening on systemd-journald.socket - Journal Socket. Jun 25 16:30:57.040635 systemd[1]: Listening on systemd-networkd.socket - Network Service Netlink Socket. Jun 25 16:30:57.040657 systemd[1]: Listening on systemd-udevd-control.socket - udev Control Socket. Jun 25 16:30:57.040683 systemd[1]: Listening on systemd-udevd-kernel.socket - udev Kernel Socket. Jun 25 16:30:57.040705 systemd[1]: Reached target sockets.target - Socket Units. Jun 25 16:30:57.040727 systemd[1]: Starting kmod-static-nodes.service - Create List of Static Device Nodes... Jun 25 16:30:57.040749 systemd[1]: Finished network-cleanup.service - Network Cleanup. Jun 25 16:30:57.040772 systemd[1]: Starting systemd-fsck-usr.service... Jun 25 16:30:57.040793 systemd[1]: Starting systemd-journald.service - Journal Service... Jun 25 16:30:57.040816 systemd[1]: Starting systemd-modules-load.service - Load Kernel Modules... Jun 25 16:30:57.040838 systemd[1]: Starting systemd-vconsole-setup.service - Setup Virtual Console... Jun 25 16:30:57.040863 systemd[1]: Finished kmod-static-nodes.service - Create List of Static Device Nodes. Jun 25 16:30:57.040885 systemd[1]: Finished systemd-fsck-usr.service. Jun 25 16:30:57.040907 systemd[1]: Starting systemd-tmpfiles-setup-dev.service - Create Static Device Nodes in /dev... Jun 25 16:30:57.040934 systemd-journald[181]: Journal started Jun 25 16:30:57.041098 systemd-journald[181]: Runtime Journal (/run/log/journal/267bf8507a58475f96f518889cf2a746) is 4.9M, max 39.3M, 34.4M free. Jun 25 16:30:57.008733 systemd-modules-load[182]: Inserted module 'overlay' Jun 25 16:30:57.072180 kernel: bridge: filtering via arp/ip/ip6tables is no longer available by default. Update your scripts to load br_netfilter if you need this. Jun 25 16:30:57.072205 kernel: Bridge firewalling registered Jun 25 16:30:57.054466 systemd-modules-load[182]: Inserted module 'br_netfilter' Jun 25 16:30:57.090117 systemd[1]: Started systemd-journald.service - Journal Service. Jun 25 16:30:57.090141 kernel: SCSI subsystem initialized Jun 25 16:30:57.090154 kernel: audit: type=1130 audit(1719333057.074:2): pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=systemd-journald comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Jun 25 16:30:57.090166 kernel: audit: type=1130 audit(1719333057.075:3): 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' Jun 25 16:30:57.090178 kernel: audit: type=1130 audit(1719333057.075:4): 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' Jun 25 16:30:57.074000 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' Jun 25 16:30:57.075000 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' Jun 25 16:30:57.075000 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' Jun 25 16:30:57.075141 systemd[1]: Finished systemd-vconsole-setup.service - Setup Virtual Console. Jun 25 16:30:57.075816 systemd[1]: Finished systemd-tmpfiles-setup-dev.service - Create Static Device Nodes in /dev. Jun 25 16:30:57.082259 systemd[1]: Starting dracut-cmdline-ask.service - dracut ask for additional cmdline parameters... Jun 25 16:30:57.089514 systemd[1]: Starting systemd-tmpfiles-setup.service - Create Volatile Files and Directories... Jun 25 16:30:57.100582 systemd[1]: Finished systemd-tmpfiles-setup.service - Create Volatile Files and Directories. Jun 25 16:30:57.108849 kernel: device-mapper: core: CONFIG_IMA_DISABLE_HTABLE is disabled. Duplicate IMA measurements will not be recorded in the IMA log. Jun 25 16:30:57.108869 kernel: device-mapper: uevent: version 1.0.3 Jun 25 16:30:57.108880 kernel: device-mapper: ioctl: 4.47.0-ioctl (2022-07-28) initialised: dm-devel@redhat.com Jun 25 16:30:57.108891 kernel: audit: type=1130 audit(1719333057.104:5): 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' Jun 25 16:30:57.104000 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' Jun 25 16:30:57.108364 systemd-modules-load[182]: Inserted module 'dm_multipath' Jun 25 16:30:57.109758 systemd[1]: Finished systemd-modules-load.service - Load Kernel Modules. Jun 25 16:30:57.116437 kernel: audit: type=1130 audit(1719333057.110:6): pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=systemd-modules-load comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Jun 25 16:30:57.110000 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' Jun 25 16:30:57.112000 audit: BPF prog-id=6 op=LOAD Jun 25 16:30:57.118422 kernel: audit: type=1334 audit(1719333057.112:7): prog-id=6 op=LOAD Jun 25 16:30:57.118592 systemd[1]: Starting systemd-resolved.service - Network Name Resolution... Jun 25 16:30:57.120918 systemd[1]: Starting systemd-sysctl.service - Apply Kernel Variables... Jun 25 16:30:57.128751 systemd[1]: Finished dracut-cmdline-ask.service - dracut ask for additional cmdline parameters. Jun 25 16:30:57.128000 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' Jun 25 16:30:57.134755 kernel: audit: type=1130 audit(1719333057.128:8): 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' Jun 25 16:30:57.136637 systemd[1]: Starting dracut-cmdline.service - dracut cmdline hook... Jun 25 16:30:57.137493 systemd[1]: Finished systemd-sysctl.service - Apply Kernel Variables. Jun 25 16:30:57.137000 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' Jun 25 16:30:57.146411 kernel: audit: type=1130 audit(1719333057.137: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' Jun 25 16:30:57.152095 dracut-cmdline[207]: dracut-dracut-053 Jun 25 16:30:57.154608 dracut-cmdline[207]: Using kernel command line parameters: rd.driver.pre=btrfs rootflags=rw mount.usrflags=ro BOOT_IMAGE=/flatcar/vmlinuz-a mount.usr=/dev/mapper/usr verity.usr=PARTUUID=7130c94a-213a-4e5a-8e26-6cce9662f132 rootflags=rw mount.usrflags=ro consoleblank=0 root=LABEL=ROOT console=ttyS0,115200n8 console=tty0 flatcar.first_boot=detected flatcar.oem.id=openstack verity.usrhash=05dd62847a393595c8cf7409b58afa2d4045a2186c3cd58722296be6f3bc4fa9 Jun 25 16:30:57.159072 systemd-resolved[198]: Positive Trust Anchors: Jun 25 16:30:57.159092 systemd-resolved[198]: . IN DS 20326 8 2 e06d44b80b8f1d39a95c0b0d7c65d08458e880409bbc683457104237c7f8ec8d Jun 25 16:30:57.159139 systemd-resolved[198]: 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 168.192.in-addr.arpa d.f.ip6.arpa corp home internal intranet lan local private test Jun 25 16:30:57.172249 kernel: audit: type=1130 audit(1719333057.165:10): 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' Jun 25 16:30:57.165000 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' Jun 25 16:30:57.162068 systemd-resolved[198]: Defaulting to hostname 'linux'. Jun 25 16:30:57.162937 systemd[1]: Started systemd-resolved.service - Network Name Resolution. Jun 25 16:30:57.165667 systemd[1]: Reached target nss-lookup.target - Host and Network Name Lookups. Jun 25 16:30:57.245436 kernel: Loading iSCSI transport class v2.0-870. Jun 25 16:30:57.259426 kernel: iscsi: registered transport (tcp) Jun 25 16:30:57.288430 kernel: iscsi: registered transport (qla4xxx) Jun 25 16:30:57.288537 kernel: QLogic iSCSI HBA Driver Jun 25 16:30:57.346563 systemd[1]: Finished dracut-cmdline.service - dracut cmdline hook. Jun 25 16:30:57.347000 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' Jun 25 16:30:57.352737 systemd[1]: Starting dracut-pre-udev.service - dracut pre-udev hook... Jun 25 16:30:57.441494 kernel: raid6: sse2x4 gen() 13081 MB/s Jun 25 16:30:57.458484 kernel: raid6: sse2x2 gen() 13842 MB/s Jun 25 16:30:57.475594 kernel: raid6: sse2x1 gen() 10957 MB/s Jun 25 16:30:57.475652 kernel: raid6: using algorithm sse2x2 gen() 13842 MB/s Jun 25 16:30:57.493690 kernel: raid6: .... xor() 8807 MB/s, rmw enabled Jun 25 16:30:57.493784 kernel: raid6: using ssse3x2 recovery algorithm Jun 25 16:30:57.498557 kernel: xor: measuring software checksum speed Jun 25 16:30:57.498614 kernel: prefetch64-sse : 18576 MB/sec Jun 25 16:30:57.501850 kernel: generic_sse : 16912 MB/sec Jun 25 16:30:57.501907 kernel: xor: using function: prefetch64-sse (18576 MB/sec) Jun 25 16:30:57.680563 kernel: Btrfs loaded, crc32c=crc32c-intel, zoned=no, fsverity=no Jun 25 16:30:57.698785 systemd[1]: Finished dracut-pre-udev.service - dracut pre-udev hook. Jun 25 16:30:57.699000 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' Jun 25 16:30:57.700000 audit: BPF prog-id=7 op=LOAD Jun 25 16:30:57.700000 audit: BPF prog-id=8 op=LOAD Jun 25 16:30:57.707706 systemd[1]: Starting systemd-udevd.service - Rule-based Manager for Device Events and Files... Jun 25 16:30:57.728935 systemd-udevd[383]: Using default interface naming scheme 'v252'. Jun 25 16:30:57.733893 systemd[1]: Started systemd-udevd.service - Rule-based Manager for Device Events and Files. Jun 25 16:30:57.739000 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' Jun 25 16:30:57.746660 systemd[1]: Starting dracut-pre-trigger.service - dracut pre-trigger hook... Jun 25 16:30:57.766000 dracut-pre-trigger[399]: rd.md=0: removing MD RAID activation Jun 25 16:30:57.818112 systemd[1]: Finished dracut-pre-trigger.service - dracut pre-trigger hook. Jun 25 16:30:57.819000 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' Jun 25 16:30:57.823721 systemd[1]: Starting systemd-udev-trigger.service - Coldplug All udev Devices... Jun 25 16:30:57.867000 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' Jun 25 16:30:57.866540 systemd[1]: Finished systemd-udev-trigger.service - Coldplug All udev Devices. Jun 25 16:30:57.919429 kernel: virtio_blk virtio2: 2/0/0 default/read/poll queues Jun 25 16:30:57.970219 kernel: virtio_blk virtio2: [vda] 41943040 512-byte logical blocks (21.5 GB/20.0 GiB) Jun 25 16:30:57.970356 kernel: libata version 3.00 loaded. Jun 25 16:30:57.970370 kernel: ata_piix 0000:00:01.1: version 2.13 Jun 25 16:30:57.970873 kernel: GPT:Primary header thinks Alt. header is not at the end of the disk. Jun 25 16:30:57.970888 kernel: GPT:17805311 != 41943039 Jun 25 16:30:57.970898 kernel: GPT:Alternate GPT header not at the end of the disk. Jun 25 16:30:57.970908 kernel: scsi host0: ata_piix Jun 25 16:30:57.971055 kernel: GPT:17805311 != 41943039 Jun 25 16:30:57.971068 kernel: scsi host1: ata_piix Jun 25 16:30:57.971186 kernel: GPT: Use GNU Parted to correct GPT errors. Jun 25 16:30:57.971198 kernel: ata1: PATA max MWDMA2 cmd 0x1f0 ctl 0x3f6 bmdma 0xc120 irq 14 Jun 25 16:30:57.971208 kernel: vda: vda1 vda2 vda3 vda4 vda6 vda7 vda9 Jun 25 16:30:57.971218 kernel: ata2: PATA max MWDMA2 cmd 0x170 ctl 0x376 bmdma 0xc128 irq 15 Jun 25 16:30:58.161449 kernel: BTRFS: device label OEM devid 1 transid 12 /dev/vda6 scanned by (udev-worker) (441) Jun 25 16:30:58.168453 kernel: BTRFS: device fsid dda7891e-deba-495b-b677-4df6bea75326 devid 1 transid 33 /dev/vda3 scanned by (udev-worker) (436) Jun 25 16:30:58.193677 systemd[1]: Found device dev-disk-by\x2dlabel-EFI\x2dSYSTEM.device - /dev/disk/by-label/EFI-SYSTEM. Jun 25 16:30:58.206117 systemd[1]: Found device dev-disk-by\x2dlabel-ROOT.device - /dev/disk/by-label/ROOT. Jun 25 16:30:58.211347 systemd[1]: Found device dev-disk-by\x2dpartlabel-USR\x2dA.device - /dev/disk/by-partlabel/USR-A. Jun 25 16:30:58.211942 systemd[1]: Found device dev-disk-by\x2dpartuuid-7130c94a\x2d213a\x2d4e5a\x2d8e26\x2d6cce9662f132.device - /dev/disk/by-partuuid/7130c94a-213a-4e5a-8e26-6cce9662f132. Jun 25 16:30:58.216934 systemd[1]: Found device dev-disk-by\x2dlabel-OEM.device - /dev/disk/by-label/OEM. Jun 25 16:30:58.227535 systemd[1]: Starting disk-uuid.service - Generate new UUID for disk GPT if necessary... Jun 25 16:30:58.239451 disk-uuid[458]: Primary Header is updated. Jun 25 16:30:58.239451 disk-uuid[458]: Secondary Entries is updated. Jun 25 16:30:58.239451 disk-uuid[458]: Secondary Header is updated. Jun 25 16:30:58.248435 kernel: vda: vda1 vda2 vda3 vda4 vda6 vda7 vda9 Jun 25 16:30:58.252431 kernel: vda: vda1 vda2 vda3 vda4 vda6 vda7 vda9 Jun 25 16:30:59.267477 kernel: vda: vda1 vda2 vda3 vda4 vda6 vda7 vda9 Jun 25 16:30:59.268476 disk-uuid[459]: The operation has completed successfully. Jun 25 16:30:59.360107 systemd[1]: disk-uuid.service: Deactivated successfully. Jun 25 16:30:59.361020 systemd[1]: Finished disk-uuid.service - Generate new UUID for disk GPT if necessary. Jun 25 16:30:59.361000 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' Jun 25 16:30:59.362000 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' Jun 25 16:30:59.379573 systemd[1]: Starting verity-setup.service - Verity Setup for /dev/mapper/usr... Jun 25 16:30:59.384822 sh[471]: Success Jun 25 16:30:59.406493 kernel: device-mapper: verity: sha256 using implementation "sha256-ssse3" Jun 25 16:30:59.510089 systemd[1]: Found device dev-mapper-usr.device - /dev/mapper/usr. Jun 25 16:30:59.524601 systemd[1]: Mounting sysusr-usr.mount - /sysusr/usr... Jun 25 16:30:59.526674 systemd[1]: Finished verity-setup.service - Verity Setup for /dev/mapper/usr. Jun 25 16:30:59.528000 audit[1]: SERVICE_START pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=verity-setup comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Jun 25 16:30:59.547068 kernel: BTRFS info (device dm-0): first mount of filesystem dda7891e-deba-495b-b677-4df6bea75326 Jun 25 16:30:59.547100 kernel: BTRFS info (device dm-0): using crc32c (crc32c-intel) checksum algorithm Jun 25 16:30:59.550718 kernel: BTRFS warning (device dm-0): 'nologreplay' is deprecated, use 'rescue=nologreplay' instead Jun 25 16:30:59.556291 kernel: BTRFS info (device dm-0): disabling log replay at mount time Jun 25 16:30:59.556314 kernel: BTRFS info (device dm-0): using free space tree Jun 25 16:30:59.580075 systemd[1]: Mounted sysusr-usr.mount - /sysusr/usr. Jun 25 16:30:59.581595 systemd[1]: afterburn-network-kargs.service - Afterburn Initrd Setup Network Kernel Arguments was skipped because no trigger condition checks were met. Jun 25 16:30:59.587050 systemd[1]: Starting ignition-setup.service - Ignition (setup)... Jun 25 16:30:59.589819 systemd[1]: Starting parse-ip-for-networkd.service - Write systemd-networkd units from cmdline... Jun 25 16:30:59.620595 kernel: BTRFS info (device vda6): first mount of filesystem 86bb1873-22f4-4b9b-84d4-c8e8b30f7c8f Jun 25 16:30:59.620680 kernel: BTRFS info (device vda6): using crc32c (crc32c-intel) checksum algorithm Jun 25 16:30:59.620709 kernel: BTRFS info (device vda6): using free space tree Jun 25 16:30:59.650545 systemd[1]: mnt-oem.mount: Deactivated successfully. Jun 25 16:30:59.659449 kernel: BTRFS info (device vda6): last unmount of filesystem 86bb1873-22f4-4b9b-84d4-c8e8b30f7c8f Jun 25 16:30:59.670911 systemd[1]: Finished ignition-setup.service - Ignition (setup). Jun 25 16:30:59.671000 audit[1]: SERVICE_START pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=ignition-setup comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Jun 25 16:30:59.677098 systemd[1]: Starting ignition-fetch-offline.service - Ignition (fetch-offline)... Jun 25 16:30:59.744000 audit[1]: SERVICE_START pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=parse-ip-for-networkd comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Jun 25 16:30:59.745000 audit: BPF prog-id=9 op=LOAD Jun 25 16:30:59.744264 systemd[1]: Finished parse-ip-for-networkd.service - Write systemd-networkd units from cmdline. Jun 25 16:30:59.749746 systemd[1]: Starting systemd-networkd.service - Network Configuration... Jun 25 16:30:59.786364 systemd-networkd[651]: lo: Link UP Jun 25 16:30:59.786373 systemd-networkd[651]: lo: Gained carrier Jun 25 16:30:59.787000 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' Jun 25 16:30:59.786844 systemd-networkd[651]: Enumeration completed Jun 25 16:30:59.786921 systemd[1]: Started systemd-networkd.service - Network Configuration. Jun 25 16:30:59.787236 systemd-networkd[651]: eth0: found matching network '/usr/lib/systemd/network/zz-default.network', based on potentially unpredictable interface name. Jun 25 16:30:59.787239 systemd-networkd[651]: eth0: Configuring with /usr/lib/systemd/network/zz-default.network. Jun 25 16:30:59.788011 systemd[1]: Reached target network.target - Network. Jun 25 16:30:59.794843 systemd-networkd[651]: eth0: Link UP Jun 25 16:30:59.794852 systemd-networkd[651]: eth0: Gained carrier Jun 25 16:30:59.794861 systemd-networkd[651]: eth0: found matching network '/usr/lib/systemd/network/zz-default.network', based on potentially unpredictable interface name. Jun 25 16:30:59.796754 systemd[1]: Starting iscsiuio.service - iSCSI UserSpace I/O driver... Jun 25 16:30:59.798740 ignition[592]: Ignition 2.15.0 Jun 25 16:30:59.798748 ignition[592]: Stage: fetch-offline Jun 25 16:30:59.805321 systemd[1]: Started iscsiuio.service - iSCSI UserSpace I/O driver. Jun 25 16:30:59.805000 audit[1]: SERVICE_START pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=iscsiuio comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Jun 25 16:30:59.798789 ignition[592]: no configs at "/usr/lib/ignition/base.d" Jun 25 16:30:59.806000 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' Jun 25 16:30:59.806407 systemd[1]: Finished ignition-fetch-offline.service - Ignition (fetch-offline). Jun 25 16:30:59.798800 ignition[592]: no config dir at "/usr/lib/ignition/base.platform.d/openstack" Jun 25 16:30:59.798962 ignition[592]: parsed url from cmdline: "" Jun 25 16:30:59.798970 ignition[592]: no config URL provided Jun 25 16:30:59.798976 ignition[592]: reading system config file "/usr/lib/ignition/user.ign" Jun 25 16:30:59.798987 ignition[592]: no config at "/usr/lib/ignition/user.ign" Jun 25 16:30:59.798993 ignition[592]: failed to fetch config: resource requires networking Jun 25 16:30:59.799123 ignition[592]: Ignition finished successfully Jun 25 16:30:59.811479 systemd-networkd[651]: eth0: DHCPv4 address 172.24.4.212/24, gateway 172.24.4.1 acquired from 172.24.4.1 Jun 25 16:30:59.820000 audit[1]: SERVICE_START pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=iscsid comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Jun 25 16:30:59.814157 systemd[1]: Starting ignition-fetch.service - Ignition (fetch)... Jun 25 16:30:59.824172 ignition[662]: Ignition 2.15.0 Jun 25 16:30:59.815546 systemd[1]: Starting iscsid.service - Open-iSCSI... Jun 25 16:30:59.828582 iscsid[663]: iscsid: can't open InitiatorName configuration file /etc/iscsi/initiatorname.iscsi Jun 25 16:30:59.828582 iscsid[663]: iscsid: Warning: InitiatorName file /etc/iscsi/initiatorname.iscsi does not exist or does not contain a properly formatted InitiatorName. If using software iscsi (iscsi_tcp or ib_iser) or partial offload (bnx2i or cxgbi iscsi), you may not be able to log Jun 25 16:30:59.828582 iscsid[663]: into or discover targets. Please create a file /etc/iscsi/initiatorname.iscsi that contains a sting with the format: InitiatorName=iqn.yyyy-mm.[:identifier]. Jun 25 16:30:59.828582 iscsid[663]: Example: InitiatorName=iqn.2001-04.com.redhat:fc6. Jun 25 16:30:59.828582 iscsid[663]: If using hardware iscsi like qla4xxx this message can be ignored. Jun 25 16:30:59.828582 iscsid[663]: iscsid: can't open InitiatorAlias configuration file /etc/iscsi/initiatorname.iscsi Jun 25 16:30:59.828582 iscsid[663]: iscsid: can't open iscsid.safe_logout configuration file /etc/iscsi/iscsid.conf Jun 25 16:30:59.833000 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' Jun 25 16:30:59.824179 ignition[662]: Stage: fetch Jun 25 16:30:59.820247 systemd[1]: Started iscsid.service - Open-iSCSI. Jun 25 16:30:59.824343 ignition[662]: no configs at "/usr/lib/ignition/base.d" Jun 25 16:30:59.822004 systemd[1]: Starting dracut-initqueue.service - dracut initqueue hook... Jun 25 16:30:59.824354 ignition[662]: no config dir at "/usr/lib/ignition/base.platform.d/openstack" Jun 25 16:30:59.833721 systemd[1]: Finished dracut-initqueue.service - dracut initqueue hook. Jun 25 16:30:59.824465 ignition[662]: parsed url from cmdline: "" Jun 25 16:30:59.834349 systemd[1]: Reached target remote-fs-pre.target - Preparation for Remote File Systems. Jun 25 16:30:59.824472 ignition[662]: no config URL provided Jun 25 16:30:59.835624 systemd[1]: Reached target remote-cryptsetup.target - Remote Encrypted Volumes. Jun 25 16:30:59.824478 ignition[662]: reading system config file "/usr/lib/ignition/user.ign" Jun 25 16:30:59.836841 systemd[1]: Reached target remote-fs.target - Remote File Systems. Jun 25 16:30:59.824487 ignition[662]: no config at "/usr/lib/ignition/user.ign" Jun 25 16:30:59.825457 ignition[662]: config drive ("/dev/disk/by-label/config-2") not found. Waiting... Jun 25 16:30:59.825479 ignition[662]: config drive ("/dev/disk/by-label/CONFIG-2") not found. Waiting... Jun 25 16:30:59.825789 ignition[662]: GET http://169.254.169.254/openstack/latest/user_data: attempt #1 Jun 25 16:30:59.845865 systemd[1]: Starting dracut-pre-mount.service - dracut pre-mount hook... Jun 25 16:30:59.851927 systemd[1]: Finished dracut-pre-mount.service - dracut pre-mount hook. Jun 25 16:30:59.852000 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' Jun 25 16:31:00.034450 ignition[662]: GET result: OK Jun 25 16:31:00.034514 ignition[662]: parsing config with SHA512: cf83e1357eefb8bdf1542850d66d8007d620e4050b5715dc83f4a921d36ce9ce47d0d13c5d85f2b0ff8318d2877eec2f63b931bd47417a81a538327af927da3e Jun 25 16:31:00.034529 ignition[662]: not a config (empty): provider config was empty, continuing with empty cache config Jun 25 16:31:00.036262 ignition[662]: fetch: fetch complete Jun 25 16:31:00.036007 unknown[662]: fetched base config from "system" Jun 25 16:31:00.036274 ignition[662]: fetch: fetch passed Jun 25 16:31:00.041000 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' Jun 25 16:31:00.036025 unknown[662]: fetched base config from "system" Jun 25 16:31:00.036355 ignition[662]: Ignition finished successfully Jun 25 16:31:00.039660 systemd[1]: Finished ignition-fetch.service - Ignition (fetch). Jun 25 16:31:00.049701 systemd[1]: Starting ignition-kargs.service - Ignition (kargs)... Jun 25 16:31:00.078866 ignition[683]: Ignition 2.15.0 Jun 25 16:31:00.078894 ignition[683]: Stage: kargs Jun 25 16:31:00.079127 ignition[683]: no configs at "/usr/lib/ignition/base.d" Jun 25 16:31:00.079155 ignition[683]: no config dir at "/usr/lib/ignition/base.platform.d/openstack" Jun 25 16:31:00.082829 systemd[1]: Finished ignition-kargs.service - Ignition (kargs). Jun 25 16:31:00.085000 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' Jun 25 16:31:00.080650 ignition[683]: kargs: kargs passed Jun 25 16:31:00.080750 ignition[683]: Ignition finished successfully Jun 25 16:31:00.092041 systemd[1]: Starting ignition-disks.service - Ignition (disks)... Jun 25 16:31:00.120577 ignition[689]: Ignition 2.15.0 Jun 25 16:31:00.120606 ignition[689]: Stage: disks Jun 25 16:31:00.120836 ignition[689]: no configs at "/usr/lib/ignition/base.d" Jun 25 16:31:00.120864 ignition[689]: no config dir at "/usr/lib/ignition/base.platform.d/openstack" Jun 25 16:31:00.125000 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' Jun 25 16:31:00.124313 systemd[1]: Finished ignition-disks.service - Ignition (disks). Jun 25 16:31:00.122277 ignition[689]: disks: disks passed Jun 25 16:31:00.126086 systemd[1]: Reached target initrd-root-device.target - Initrd Root Device. Jun 25 16:31:00.122371 ignition[689]: Ignition finished successfully Jun 25 16:31:00.128783 systemd[1]: Reached target local-fs-pre.target - Preparation for Local File Systems. Jun 25 16:31:00.131242 systemd[1]: Reached target local-fs.target - Local File Systems. Jun 25 16:31:00.133526 systemd[1]: Reached target sysinit.target - System Initialization. Jun 25 16:31:00.136232 systemd[1]: Reached target basic.target - Basic System. Jun 25 16:31:00.144793 systemd[1]: Starting systemd-fsck-root.service - File System Check on /dev/disk/by-label/ROOT... Jun 25 16:31:00.174574 systemd-fsck[698]: ROOT: clean, 14/1628000 files, 120691/1617920 blocks Jun 25 16:31:00.189339 systemd[1]: Finished systemd-fsck-root.service - File System Check on /dev/disk/by-label/ROOT. Jun 25 16:31:00.190000 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' Jun 25 16:31:00.195587 systemd[1]: Mounting sysroot.mount - /sysroot... Jun 25 16:31:00.332404 kernel: EXT4-fs (vda9): mounted filesystem with ordered data mode. Quota mode: none. Jun 25 16:31:00.333954 systemd[1]: Mounted sysroot.mount - /sysroot. Jun 25 16:31:00.335267 systemd[1]: Reached target initrd-root-fs.target - Initrd Root File System. Jun 25 16:31:00.345575 systemd[1]: Mounting sysroot-oem.mount - /sysroot/oem... Jun 25 16:31:00.348283 systemd[1]: Mounting sysroot-usr.mount - /sysroot/usr... Jun 25 16:31:00.349434 systemd[1]: flatcar-metadata-hostname.service - Flatcar Metadata Hostname Agent was skipped because no trigger condition checks were met. Jun 25 16:31:00.350165 systemd[1]: Starting flatcar-openstack-hostname.service - Flatcar OpenStack Metadata Hostname Agent... Jun 25 16:31:00.350926 systemd[1]: ignition-remount-sysroot.service - Remount /sysroot read-write for Ignition was skipped because of an unmet condition check (ConditionPathIsReadWrite=!/sysroot). Jun 25 16:31:00.351005 systemd[1]: Reached target ignition-diskful.target - Ignition Boot Disk Setup. Jun 25 16:31:00.370429 kernel: BTRFS: device label OEM devid 1 transid 13 /dev/vda6 scanned by mount (704) Jun 25 16:31:00.371165 systemd[1]: Mounted sysroot-usr.mount - /sysroot/usr. Jun 25 16:31:00.372758 kernel: BTRFS info (device vda6): first mount of filesystem 86bb1873-22f4-4b9b-84d4-c8e8b30f7c8f Jun 25 16:31:00.373402 kernel: BTRFS info (device vda6): using crc32c (crc32c-intel) checksum algorithm Jun 25 16:31:00.373424 kernel: BTRFS info (device vda6): using free space tree Jun 25 16:31:00.389663 systemd[1]: Starting initrd-setup-root.service - Root filesystem setup... Jun 25 16:31:00.408470 systemd[1]: Mounted sysroot-oem.mount - /sysroot/oem. Jun 25 16:31:00.485511 initrd-setup-root[731]: cut: /sysroot/etc/passwd: No such file or directory Jun 25 16:31:00.494250 initrd-setup-root[738]: cut: /sysroot/etc/group: No such file or directory Jun 25 16:31:00.502175 initrd-setup-root[745]: cut: /sysroot/etc/shadow: No such file or directory Jun 25 16:31:00.510707 initrd-setup-root[752]: cut: /sysroot/etc/gshadow: No such file or directory Jun 25 16:31:00.515417 coreos-metadata[706]: Jun 25 16:31:00.515 INFO Fetching http://169.254.169.254/latest/meta-data/hostname: Attempt #1 Jun 25 16:31:00.530918 coreos-metadata[706]: Jun 25 16:31:00.530 INFO Fetch successful Jun 25 16:31:00.531635 coreos-metadata[706]: Jun 25 16:31:00.531 INFO wrote hostname ci-3815-2-4-1-fc28402a5e.novalocal to /sysroot/etc/hostname Jun 25 16:31:00.534724 systemd[1]: flatcar-openstack-hostname.service: Deactivated successfully. Jun 25 16:31:00.534830 systemd[1]: Finished flatcar-openstack-hostname.service - Flatcar OpenStack Metadata Hostname Agent. Jun 25 16:31:00.539000 audit[1]: SERVICE_START pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=flatcar-openstack-hostname comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Jun 25 16:31:00.540000 audit[1]: SERVICE_STOP pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=flatcar-openstack-hostname comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Jun 25 16:31:00.604058 systemd[1]: Finished initrd-setup-root.service - Root filesystem setup. Jun 25 16:31:00.604000 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' Jun 25 16:31:00.610525 systemd[1]: Starting ignition-mount.service - Ignition (mount)... Jun 25 16:31:00.611818 systemd[1]: Starting sysroot-boot.service - /sysroot/boot... Jun 25 16:31:00.617571 systemd[1]: sysroot-oem.mount: Deactivated successfully. Jun 25 16:31:00.621409 kernel: BTRFS info (device vda6): last unmount of filesystem 86bb1873-22f4-4b9b-84d4-c8e8b30f7c8f Jun 25 16:31:00.639542 ignition[818]: INFO : Ignition 2.15.0 Jun 25 16:31:00.639542 ignition[818]: INFO : Stage: mount Jun 25 16:31:00.640710 ignition[818]: INFO : no configs at "/usr/lib/ignition/base.d" Jun 25 16:31:00.640710 ignition[818]: INFO : no config dir at "/usr/lib/ignition/base.platform.d/openstack" Jun 25 16:31:00.640710 ignition[818]: INFO : mount: mount passed Jun 25 16:31:00.640710 ignition[818]: INFO : Ignition finished successfully Jun 25 16:31:00.643203 systemd[1]: Finished ignition-mount.service - Ignition (mount). Jun 25 16:31:00.643000 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' Jun 25 16:31:00.647556 systemd[1]: Starting ignition-files.service - Ignition (files)... Jun 25 16:31:00.650622 systemd[1]: Finished sysroot-boot.service - /sysroot/boot. Jun 25 16:31:00.651000 audit[1]: SERVICE_START pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=sysroot-boot comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Jun 25 16:31:00.654547 systemd[1]: Mounting sysroot-oem.mount - /sysroot/oem... Jun 25 16:31:00.663433 kernel: BTRFS: device label OEM devid 1 transid 14 /dev/vda6 scanned by mount (829) Jun 25 16:31:00.666495 kernel: BTRFS info (device vda6): first mount of filesystem 86bb1873-22f4-4b9b-84d4-c8e8b30f7c8f Jun 25 16:31:00.666516 kernel: BTRFS info (device vda6): using crc32c (crc32c-intel) checksum algorithm Jun 25 16:31:00.668529 kernel: BTRFS info (device vda6): using free space tree Jun 25 16:31:00.675654 systemd[1]: Mounted sysroot-oem.mount - /sysroot/oem. Jun 25 16:31:00.694782 ignition[847]: INFO : Ignition 2.15.0 Jun 25 16:31:00.694782 ignition[847]: INFO : Stage: files Jun 25 16:31:00.695914 ignition[847]: INFO : no configs at "/usr/lib/ignition/base.d" Jun 25 16:31:00.695914 ignition[847]: INFO : no config dir at "/usr/lib/ignition/base.platform.d/openstack" Jun 25 16:31:00.695914 ignition[847]: DEBUG : files: compiled without relabeling support, skipping Jun 25 16:31:00.695914 ignition[847]: INFO : files: createResultFile: createFiles: op(1): [started] writing file "/sysroot/etc/.ignition-result.json" Jun 25 16:31:00.695914 ignition[847]: INFO : files: createResultFile: createFiles: op(1): [finished] writing file "/sysroot/etc/.ignition-result.json" Jun 25 16:31:00.697000 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' Jun 25 16:31:00.700211 ignition[847]: INFO : files: files passed Jun 25 16:31:00.700211 ignition[847]: INFO : Ignition finished successfully Jun 25 16:31:00.696796 systemd[1]: Finished ignition-files.service - Ignition (files). Jun 25 16:31:00.701515 systemd[1]: Starting ignition-quench.service - Ignition (record completion)... Jun 25 16:31:00.705125 systemd[1]: Starting initrd-setup-root-after-ignition.service - Root filesystem completion... Jun 25 16:31:00.706000 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' Jun 25 16:31:00.706000 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' Jun 25 16:31:00.705868 systemd[1]: ignition-quench.service: Deactivated successfully. Jun 25 16:31:00.705951 systemd[1]: Finished ignition-quench.service - Ignition (record completion). Jun 25 16:31:00.714301 initrd-setup-root-after-ignition[865]: grep: /sysroot/etc/flatcar/enabled-sysext.conf: No such file or directory Jun 25 16:31:00.714301 initrd-setup-root-after-ignition[865]: grep: /sysroot/usr/share/flatcar/enabled-sysext.conf: No such file or directory Jun 25 16:31:00.715975 initrd-setup-root-after-ignition[869]: grep: /sysroot/etc/flatcar/enabled-sysext.conf: No such file or directory Jun 25 16:31:00.717189 systemd[1]: Finished initrd-setup-root-after-ignition.service - Root filesystem completion. Jun 25 16:31:00.717000 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' Jun 25 16:31:00.717890 systemd[1]: Reached target ignition-complete.target - Ignition Complete. Jun 25 16:31:00.722676 systemd[1]: Starting initrd-parse-etc.service - Mountpoints Configured in the Real Root... Jun 25 16:31:00.735050 systemd[1]: initrd-parse-etc.service: Deactivated successfully. Jun 25 16:31:00.735169 systemd[1]: Finished initrd-parse-etc.service - Mountpoints Configured in the Real Root. Jun 25 16:31:00.735000 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' Jun 25 16:31:00.735000 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' Jun 25 16:31:00.736316 systemd[1]: Reached target initrd-fs.target - Initrd File Systems. Jun 25 16:31:00.737377 systemd[1]: Reached target initrd.target - Initrd Default Target. Jun 25 16:31:00.738618 systemd[1]: dracut-mount.service - dracut mount hook was skipped because no trigger condition checks were met. Jun 25 16:31:00.739351 systemd[1]: Starting dracut-pre-pivot.service - dracut pre-pivot and cleanup hook... Jun 25 16:31:00.751015 systemd[1]: Finished dracut-pre-pivot.service - dracut pre-pivot and cleanup hook. Jun 25 16:31:00.751000 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' Jun 25 16:31:00.755684 systemd[1]: Starting initrd-cleanup.service - Cleaning Up and Shutting Down Daemons... Jun 25 16:31:00.764867 systemd[1]: Stopped target nss-lookup.target - Host and Network Name Lookups. Jun 25 16:31:00.766263 systemd[1]: Stopped target remote-cryptsetup.target - Remote Encrypted Volumes. Jun 25 16:31:00.766901 systemd[1]: Stopped target timers.target - Timer Units. Jun 25 16:31:00.767989 systemd[1]: dracut-pre-pivot.service: Deactivated successfully. Jun 25 16:31:00.768000 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' Jun 25 16:31:00.768143 systemd[1]: Stopped dracut-pre-pivot.service - dracut pre-pivot and cleanup hook. Jun 25 16:31:00.769130 systemd[1]: Stopped target initrd.target - Initrd Default Target. Jun 25 16:31:00.769897 systemd[1]: Stopped target basic.target - Basic System. Jun 25 16:31:00.770960 systemd[1]: Stopped target ignition-complete.target - Ignition Complete. Jun 25 16:31:00.771941 systemd[1]: Stopped target ignition-diskful.target - Ignition Boot Disk Setup. Jun 25 16:31:00.772891 systemd[1]: Stopped target initrd-root-device.target - Initrd Root Device. Jun 25 16:31:00.774064 systemd[1]: Stopped target remote-fs.target - Remote File Systems. Jun 25 16:31:00.775167 systemd[1]: Stopped target remote-fs-pre.target - Preparation for Remote File Systems. Jun 25 16:31:00.776312 systemd[1]: Stopped target sysinit.target - System Initialization. Jun 25 16:31:00.778725 systemd[1]: Stopped target local-fs.target - Local File Systems. Jun 25 16:31:00.780865 systemd[1]: Stopped target local-fs-pre.target - Preparation for Local File Systems. Jun 25 16:31:00.782911 systemd[1]: Stopped target swap.target - Swaps. Jun 25 16:31:00.786000 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' Jun 25 16:31:00.784717 systemd[1]: dracut-pre-mount.service: Deactivated successfully. Jun 25 16:31:00.784884 systemd[1]: Stopped dracut-pre-mount.service - dracut pre-mount hook. Jun 25 16:31:00.790000 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' Jun 25 16:31:00.787102 systemd[1]: Stopped target cryptsetup.target - Local Encrypted Volumes. Jun 25 16:31:00.792000 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' Jun 25 16:31:00.788591 systemd[1]: dracut-initqueue.service: Deactivated successfully. Jun 25 16:31:00.794000 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' Jun 25 16:31:00.788755 systemd[1]: Stopped dracut-initqueue.service - dracut initqueue hook. Jun 25 16:31:00.790512 systemd[1]: initrd-setup-root-after-ignition.service: Deactivated successfully. Jun 25 16:31:00.790676 systemd[1]: Stopped initrd-setup-root-after-ignition.service - Root filesystem completion. Jun 25 16:31:00.792508 systemd[1]: ignition-files.service: Deactivated successfully. Jun 25 16:31:00.792662 systemd[1]: Stopped ignition-files.service - Ignition (files). Jun 25 16:31:00.805000 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' Jun 25 16:31:00.803926 systemd[1]: Stopping ignition-mount.service - Ignition (mount)... Jun 25 16:31:00.808000 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' Jun 25 16:31:00.809000 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' Jun 25 16:31:00.804863 systemd[1]: kmod-static-nodes.service: Deactivated successfully. Jun 25 16:31:00.805139 systemd[1]: Stopped kmod-static-nodes.service - Create List of Static Device Nodes. Jun 25 16:31:00.807328 systemd[1]: Stopping sysroot-boot.service - /sysroot/boot... Jun 25 16:31:00.807933 systemd[1]: systemd-udev-trigger.service: Deactivated successfully. Jun 25 16:31:00.815000 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' Jun 25 16:31:00.815000 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' Jun 25 16:31:00.808115 systemd[1]: Stopped systemd-udev-trigger.service - Coldplug All udev Devices. Jun 25 16:31:00.808798 systemd[1]: dracut-pre-trigger.service: Deactivated successfully. Jun 25 16:31:00.808920 systemd[1]: Stopped dracut-pre-trigger.service - dracut pre-trigger hook. Jun 25 16:31:00.814189 systemd[1]: initrd-cleanup.service: Deactivated successfully. Jun 25 16:31:00.814276 systemd[1]: Finished initrd-cleanup.service - Cleaning Up and Shutting Down Daemons. Jun 25 16:31:00.826300 ignition[883]: INFO : Ignition 2.15.0 Jun 25 16:31:00.826300 ignition[883]: INFO : Stage: umount Jun 25 16:31:00.826300 ignition[883]: INFO : no configs at "/usr/lib/ignition/base.d" Jun 25 16:31:00.826300 ignition[883]: INFO : no config dir at "/usr/lib/ignition/base.platform.d/openstack" Jun 25 16:31:00.826300 ignition[883]: INFO : umount: umount passed Jun 25 16:31:00.826300 ignition[883]: INFO : Ignition finished successfully Jun 25 16:31:00.827000 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' Jun 25 16:31:00.828000 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' Jun 25 16:31:00.830000 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' Jun 25 16:31:00.830000 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' Jun 25 16:31:00.831000 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' Jun 25 16:31:00.826516 systemd[1]: ignition-mount.service: Deactivated successfully. Jun 25 16:31:00.845034 kernel: kauditd_printk_skb: 50 callbacks suppressed Jun 25 16:31:00.845055 kernel: audit: type=1131 audit(1719333060.838:61): pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=ignition-setup comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Jun 25 16:31:00.838000 audit[1]: SERVICE_STOP pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=ignition-setup comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Jun 25 16:31:00.826601 systemd[1]: Stopped ignition-mount.service - Ignition (mount). Jun 25 16:31:00.827745 systemd[1]: ignition-disks.service: Deactivated successfully. Jun 25 16:31:00.827785 systemd[1]: Stopped ignition-disks.service - Ignition (disks). Jun 25 16:31:00.828617 systemd[1]: ignition-kargs.service: Deactivated successfully. Jun 25 16:31:00.828653 systemd[1]: Stopped ignition-kargs.service - Ignition (kargs). Jun 25 16:31:00.830750 systemd[1]: ignition-fetch.service: Deactivated successfully. Jun 25 16:31:00.854192 kernel: audit: type=1131 audit(1719333060.849:62): pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=sysroot-boot comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Jun 25 16:31:00.849000 audit[1]: SERVICE_STOP pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=sysroot-boot comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Jun 25 16:31:00.830795 systemd[1]: Stopped ignition-fetch.service - Ignition (fetch). Jun 25 16:31:00.858914 kernel: audit: type=1131 audit(1719333060.854:63): 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' Jun 25 16:31:00.854000 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' Jun 25 16:31:00.831279 systemd[1]: Stopped target network.target - Network. Jun 25 16:31:00.831762 systemd[1]: ignition-fetch-offline.service: Deactivated successfully. Jun 25 16:31:00.864656 kernel: audit: type=1131 audit(1719333060.859:64): 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' Jun 25 16:31:00.859000 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' Jun 25 16:31:00.831805 systemd[1]: Stopped ignition-fetch-offline.service - Ignition (fetch-offline). Jun 25 16:31:00.867198 kernel: audit: type=1334 audit(1719333060.864:65): prog-id=6 op=UNLOAD Jun 25 16:31:00.864000 audit: BPF prog-id=6 op=UNLOAD Jun 25 16:31:00.832341 systemd[1]: Stopped target paths.target - Path Units. Jun 25 16:31:00.867000 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' Jun 25 16:31:00.832820 systemd[1]: systemd-ask-password-console.path: Deactivated successfully. Jun 25 16:31:00.835489 systemd[1]: Stopped systemd-ask-password-console.path - Dispatch Password Requests to Console Directory Watch. Jun 25 16:31:00.873108 kernel: audit: type=1131 audit(1719333060.867:66): 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' Jun 25 16:31:00.836161 systemd[1]: Stopped target slices.target - Slice Units. Jun 25 16:31:00.836710 systemd[1]: Stopped target sockets.target - Socket Units. Jun 25 16:31:00.837215 systemd[1]: iscsid.socket: Deactivated successfully. Jun 25 16:31:00.837242 systemd[1]: Closed iscsid.socket - Open-iSCSI iscsid Socket. Jun 25 16:31:00.837809 systemd[1]: iscsiuio.socket: Deactivated successfully. Jun 25 16:31:00.837834 systemd[1]: Closed iscsiuio.socket - Open-iSCSI iscsiuio Socket. Jun 25 16:31:00.877000 audit[1]: SERVICE_STOP pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=parse-ip-for-networkd comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Jun 25 16:31:00.838336 systemd[1]: ignition-setup.service: Deactivated successfully. Jun 25 16:31:00.886001 kernel: audit: type=1131 audit(1719333060.877:67): pid=1 uid=0 auid=4294967295 ses=4294967295 subj=kernel msg='unit=parse-ip-for-networkd comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Jun 25 16:31:00.886026 kernel: audit: type=1131 audit(1719333060.881:68): 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' Jun 25 16:31:00.881000 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' Jun 25 16:31:00.838402 systemd[1]: Stopped ignition-setup.service - Ignition (setup). Jun 25 16:31:00.890491 kernel: audit: type=1131 audit(1719333060.886:69): 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' Jun 25 16:31:00.886000 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' Jun 25 16:31:00.839080 systemd[1]: Stopping systemd-networkd.service - Network Configuration... Jun 25 16:31:00.898262 kernel: audit: type=1131 audit(1719333060.890:70): 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' Jun 25 16:31:00.890000 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' Jun 25 16:31:00.846486 systemd[1]: Stopping systemd-resolved.service - Network Name Resolution... Jun 25 16:31:00.847211 systemd[1]: sysroot-boot.service: Deactivated successfully. Jun 25 16:31:00.847606 systemd-networkd[651]: eth0: DHCPv6 lease lost Jun 25 16:31:00.899000 audit: BPF prog-id=9 op=UNLOAD Jun 25 16:31:00.848508 systemd[1]: Stopped sysroot-boot.service - /sysroot/boot. Jun 25 16:31:00.850479 systemd[1]: systemd-networkd.service: Deactivated successfully. Jun 25 16:31:00.850587 systemd[1]: Stopped systemd-networkd.service - Network Configuration. Jun 25 16:31:00.855045 systemd[1]: systemd-resolved.service: Deactivated successfully. Jun 25 16:31:00.855157 systemd[1]: Stopped systemd-resolved.service - Network Name Resolution. Jun 25 16:31:00.860563 systemd[1]: systemd-networkd.socket: Deactivated successfully. Jun 25 16:31:00.860597 systemd[1]: Closed systemd-networkd.socket - Network Service Netlink Socket. Jun 25 16:31:00.866528 systemd[1]: initrd-setup-root.service: Deactivated successfully. Jun 25 16:31:00.866572 systemd[1]: Stopped initrd-setup-root.service - Root filesystem setup. Jun 25 16:31:00.875459 systemd[1]: Stopping network-cleanup.service - Network Cleanup... Jun 25 16:31:00.906000 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' Jun 25 16:31:00.876430 systemd[1]: parse-ip-for-networkd.service: Deactivated successfully. Jun 25 16:31:00.907000 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' Jun 25 16:31:00.876477 systemd[1]: Stopped parse-ip-for-networkd.service - Write systemd-networkd units from cmdline. Jun 25 16:31:00.877855 systemd[1]: systemd-sysctl.service: Deactivated successfully. Jun 25 16:31:00.877907 systemd[1]: Stopped systemd-sysctl.service - Apply Kernel Variables. Jun 25 16:31:00.910000 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' Jun 25 16:31:00.882312 systemd[1]: systemd-modules-load.service: Deactivated successfully. Jun 25 16:31:00.911000 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' Jun 25 16:31:00.882353 systemd[1]: Stopped systemd-modules-load.service - Load Kernel Modules. Jun 25 16:31:00.913000 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' Jun 25 16:31:00.886524 systemd[1]: systemd-tmpfiles-setup.service: Deactivated successfully. Jun 25 16:31:00.886563 systemd[1]: Stopped systemd-tmpfiles-setup.service - Create Volatile Files and Directories. Jun 25 16:31:00.894023 systemd[1]: Stopping systemd-udevd.service - Rule-based Manager for Device Events and Files... Jun 25 16:31:00.903908 systemd[1]: systemd-udevd.service: Deactivated successfully. Jun 25 16:31:00.905599 systemd[1]: Stopped systemd-udevd.service - Rule-based Manager for Device Events and Files. Jun 25 16:31:00.907137 systemd[1]: network-cleanup.service: Deactivated successfully. Jun 25 16:31:00.907228 systemd[1]: Stopped network-cleanup.service - Network Cleanup. Jun 25 16:31:00.907995 systemd[1]: systemd-udevd-control.socket: Deactivated successfully. Jun 25 16:31:00.908029 systemd[1]: Closed systemd-udevd-control.socket - udev Control Socket. Jun 25 16:31:00.908943 systemd[1]: systemd-udevd-kernel.socket: Deactivated successfully. Jun 25 16:31:00.908988 systemd[1]: Closed systemd-udevd-kernel.socket - udev Kernel Socket. Jun 25 16:31:00.910168 systemd[1]: dracut-pre-udev.service: Deactivated successfully. Jun 25 16:31:00.910208 systemd[1]: Stopped dracut-pre-udev.service - dracut pre-udev hook. Jun 25 16:31:00.911234 systemd[1]: dracut-cmdline.service: Deactivated successfully. Jun 25 16:31:00.911269 systemd[1]: Stopped dracut-cmdline.service - dracut cmdline hook. Jun 25 16:31:00.912301 systemd[1]: dracut-cmdline-ask.service: Deactivated successfully. Jun 25 16:31:00.912338 systemd[1]: Stopped dracut-cmdline-ask.service - dracut ask for additional cmdline parameters. Jun 25 16:31:00.923226 systemd[1]: Starting initrd-udevadm-cleanup-db.service - Cleanup udev Database... Jun 25 16:31:00.925000 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' Jun 25 16:31:00.924234 systemd[1]: systemd-vconsole-setup.service: Deactivated successfully. Jun 25 16:31:00.926000 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' Jun 25 16:31:00.926000 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' Jun 25 16:31:00.924285 systemd[1]: Stopped systemd-vconsole-setup.service - Setup Virtual Console. Jun 25 16:31:00.926036 systemd[1]: initrd-udevadm-cleanup-db.service: Deactivated successfully. Jun 25 16:31:00.926123 systemd[1]: Finished initrd-udevadm-cleanup-db.service - Cleanup udev Database. Jun 25 16:31:00.926903 systemd[1]: Reached target initrd-switch-root.target - Switch Root. Jun 25 16:31:00.928585 systemd[1]: Starting initrd-switch-root.service - Switch Root... Jun 25 16:31:00.936932 systemd[1]: Switching root. Jun 25 16:31:00.946754 iscsid[663]: iscsid shutting down. Jun 25 16:31:00.947282 systemd-journald[181]: Journal stopped Jun 25 16:31:02.181587 systemd-journald[181]: Received SIGTERM from PID 1 (systemd). Jun 25 16:31:02.181636 kernel: SELinux: Permission cmd in class io_uring not defined in policy. Jun 25 16:31:02.181656 kernel: SELinux: the above unknown classes and permissions will be allowed Jun 25 16:31:02.181667 kernel: SELinux: policy capability network_peer_controls=1 Jun 25 16:31:02.181678 kernel: SELinux: policy capability open_perms=1 Jun 25 16:31:02.181688 kernel: SELinux: policy capability extended_socket_class=1 Jun 25 16:31:02.181702 kernel: SELinux: policy capability always_check_network=0 Jun 25 16:31:02.181712 kernel: SELinux: policy capability cgroup_seclabel=1 Jun 25 16:31:02.181722 kernel: SELinux: policy capability nnp_nosuid_transition=1 Jun 25 16:31:02.181732 kernel: SELinux: policy capability genfs_seclabel_symlinks=0 Jun 25 16:31:02.181743 kernel: SELinux: policy capability ioctl_skip_cloexec=0 Jun 25 16:31:02.181754 systemd[1]: Successfully loaded SELinux policy in 56.936ms. Jun 25 16:31:02.181771 systemd[1]: Relabelled /dev, /dev/shm, /run, /sys/fs/cgroup in 22.085ms. Jun 25 16:31:02.181783 systemd[1]: systemd 252 running in system mode (+PAM +AUDIT +SELINUX -APPARMOR +IMA +SMACK +SECCOMP +GCRYPT -GNUTLS +OPENSSL -ACL +BLKID +CURL +ELFUTILS -FIDO2 +IDN2 -IDN +IPTC +KMOD +LIBCRYPTSETUP +LIBFDISK +PCRE2 -PWQUALITY -P11KIT -QRENCODE -TPM2 +BZIP2 +LZ4 +XZ +ZLIB +ZSTD -BPF_FRAMEWORK -XKBCOMMON +UTMP +SYSVINIT default-hierarchy=unified) Jun 25 16:31:02.181797 systemd[1]: Detected virtualization kvm. Jun 25 16:31:02.181808 systemd[1]: Detected architecture x86-64. Jun 25 16:31:02.181822 systemd[1]: Detected first boot. Jun 25 16:31:02.181834 systemd[1]: Hostname set to . Jun 25 16:31:02.181849 systemd[1]: Initializing machine ID from VM UUID. Jun 25 16:31:02.181860 systemd[1]: Populated /etc with preset unit settings. Jun 25 16:31:02.181871 systemd[1]: iscsiuio.service: Deactivated successfully. Jun 25 16:31:02.181883 systemd[1]: Stopped iscsiuio.service - iSCSI UserSpace I/O driver. Jun 25 16:31:02.181895 systemd[1]: iscsid.service: Deactivated successfully. Jun 25 16:31:02.181906 systemd[1]: Stopped iscsid.service - Open-iSCSI. Jun 25 16:31:02.181917 systemd[1]: initrd-switch-root.service: Deactivated successfully. Jun 25 16:31:02.181928 systemd[1]: Stopped initrd-switch-root.service - Switch Root. Jun 25 16:31:02.181941 systemd[1]: systemd-journald.service: Scheduled restart job, restart counter is at 1. Jun 25 16:31:02.181953 systemd[1]: Created slice system-addon\x2dconfig.slice - Slice /system/addon-config. Jun 25 16:31:02.181964 systemd[1]: Created slice system-addon\x2drun.slice - Slice /system/addon-run. Jun 25 16:31:02.181975 systemd[1]: Created slice system-getty.slice - Slice /system/getty. Jun 25 16:31:02.181988 systemd[1]: Created slice system-modprobe.slice - Slice /system/modprobe. Jun 25 16:31:02.182000 systemd[1]: Created slice system-serial\x2dgetty.slice - Slice /system/serial-getty. Jun 25 16:31:02.182011 systemd[1]: Created slice system-system\x2dcloudinit.slice - Slice /system/system-cloudinit. Jun 25 16:31:02.182023 systemd[1]: Created slice system-systemd\x2dfsck.slice - Slice /system/systemd-fsck. Jun 25 16:31:02.182034 systemd[1]: Created slice user.slice - User and Session Slice. Jun 25 16:31:02.182046 systemd[1]: Started systemd-ask-password-console.path - Dispatch Password Requests to Console Directory Watch. Jun 25 16:31:02.182057 systemd[1]: Started systemd-ask-password-wall.path - Forward Password Requests to Wall Directory Watch. Jun 25 16:31:02.182068 systemd[1]: Set up automount boot.automount - Boot partition Automount Point. Jun 25 16:31:02.182080 systemd[1]: Set up automount proc-sys-fs-binfmt_misc.automount - Arbitrary Executable File Formats File System Automount Point. Jun 25 16:31:02.182093 systemd[1]: Stopped target initrd-switch-root.target - Switch Root. Jun 25 16:31:02.182105 systemd[1]: Stopped target initrd-fs.target - Initrd File Systems. Jun 25 16:31:02.182118 systemd[1]: Stopped target initrd-root-fs.target - Initrd Root File System. Jun 25 16:31:02.182129 systemd[1]: Reached target integritysetup.target - Local Integrity Protected Volumes. Jun 25 16:31:02.182140 systemd[1]: Reached target remote-cryptsetup.target - Remote Encrypted Volumes. Jun 25 16:31:02.182152 systemd[1]: Reached target remote-fs.target - Remote File Systems. Jun 25 16:31:02.182164 systemd[1]: Reached target slices.target - Slice Units. Jun 25 16:31:02.182176 systemd[1]: Reached target swap.target - Swaps. Jun 25 16:31:02.182188 systemd[1]: Reached target veritysetup.target - Local Verity Protected Volumes. Jun 25 16:31:02.182199 systemd[1]: Listening on systemd-coredump.socket - Process Core Dump Socket. Jun 25 16:31:02.182211 systemd[1]: Listening on systemd-initctl.socket - initctl Compatibility Named Pipe. Jun 25 16:31:02.182222 systemd[1]: Listening on systemd-networkd.socket - Network Service Netlink Socket. Jun 25 16:31:02.182236 systemd[1]: Listening on systemd-udevd-control.socket - udev Control Socket. Jun 25 16:31:02.182247 systemd[1]: Listening on systemd-udevd-kernel.socket - udev Kernel Socket. Jun 25 16:31:02.182258 systemd[1]: Listening on systemd-userdbd.socket - User Database Manager Socket. Jun 25 16:31:02.182270 systemd[1]: Mounting dev-hugepages.mount - Huge Pages File System... Jun 25 16:31:02.182281 systemd[1]: Mounting dev-mqueue.mount - POSIX Message Queue File System... Jun 25 16:31:02.182292 systemd[1]: Mounting media.mount - External Media Directory... Jun 25 16:31:02.182303 systemd[1]: proc-xen.mount - /proc/xen was skipped because of an unmet condition check (ConditionVirtualization=xen). Jun 25 16:31:02.182318 systemd[1]: Mounting sys-kernel-debug.mount - Kernel Debug File System... Jun 25 16:31:02.182331 systemd[1]: Mounting sys-kernel-tracing.mount - Kernel Trace File System... Jun 25 16:31:02.182342 systemd[1]: Mounting tmp.mount - Temporary Directory /tmp... Jun 25 16:31:02.182354 systemd[1]: Starting flatcar-tmpfiles.service - Create missing system files... Jun 25 16:31:02.182365 systemd[1]: ignition-delete-config.service - Ignition (delete config) was skipped because no trigger condition checks were met. Jun 25 16:31:02.182376 systemd[1]: Starting kmod-static-nodes.service - Create List of Static Device Nodes... Jun 25 16:31:02.186594 systemd[1]: Starting modprobe@configfs.service - Load Kernel Module configfs... Jun 25 16:31:02.186616 systemd[1]: Starting modprobe@dm_mod.service - Load Kernel Module dm_mod... Jun 25 16:31:02.186629 systemd[1]: Starting modprobe@drm.service - Load Kernel Module drm... Jun 25 16:31:02.186641 systemd[1]: Starting modprobe@efi_pstore.service - Load Kernel Module efi_pstore... Jun 25 16:31:02.186657 systemd[1]: Starting modprobe@fuse.service - Load Kernel Module fuse... Jun 25 16:31:02.186668 systemd[1]: Starting modprobe@loop.service - Load Kernel Module loop... Jun 25 16:31:02.186680 systemd[1]: setup-nsswitch.service - Create /etc/nsswitch.conf was skipped because of an unmet condition check (ConditionPathExists=!/etc/nsswitch.conf). Jun 25 16:31:02.186692 systemd[1]: systemd-fsck-root.service: Deactivated successfully. Jun 25 16:31:02.186703 systemd[1]: Stopped systemd-fsck-root.service - File System Check on Root Device. Jun 25 16:31:02.186714 systemd[1]: systemd-fsck-usr.service: Deactivated successfully. Jun 25 16:31:02.186726 systemd[1]: Stopped systemd-fsck-usr.service. Jun 25 16:31:02.186737 systemd[1]: Stopped systemd-journald.service - Journal Service. Jun 25 16:31:02.186750 systemd[1]: Starting systemd-journald.service - Journal Service... Jun 25 16:31:02.186761 systemd[1]: Starting systemd-modules-load.service - Load Kernel Modules... Jun 25 16:31:02.186773 systemd[1]: Starting systemd-network-generator.service - Generate network units from Kernel command line... Jun 25 16:31:02.186785 systemd[1]: Starting systemd-remount-fs.service - Remount Root and Kernel File Systems... Jun 25 16:31:02.186796 systemd[1]: Starting systemd-udev-trigger.service - Coldplug All udev Devices... Jun 25 16:31:02.186807 systemd[1]: verity-setup.service: Deactivated successfully. Jun 25 16:31:02.186819 systemd[1]: Stopped verity-setup.service. Jun 25 16:31:02.186831 systemd[1]: xenserver-pv-version.service - Set fake PV driver version for XenServer was skipped because of an unmet condition check (ConditionVirtualization=xen). Jun 25 16:31:02.186842 systemd[1]: Mounted dev-hugepages.mount - Huge Pages File System. Jun 25 16:31:02.186855 systemd[1]: Mounted dev-mqueue.mount - POSIX Message Queue File System. Jun 25 16:31:02.186867 systemd[1]: Mounted media.mount - External Media Directory. Jun 25 16:31:02.186878 systemd[1]: Mounted sys-kernel-debug.mount - Kernel Debug File System. Jun 25 16:31:02.186889 systemd[1]: Mounted sys-kernel-tracing.mount - Kernel Trace File System. Jun 25 16:31:02.186900 systemd[1]: Mounted tmp.mount - Temporary Directory /tmp. Jun 25 16:31:02.186947 systemd[1]: Finished kmod-static-nodes.service - Create List of Static Device Nodes. Jun 25 16:31:02.186961 systemd[1]: modprobe@dm_mod.service: Deactivated successfully. Jun 25 16:31:02.186972 systemd[1]: Finished modprobe@dm_mod.service - Load Kernel Module dm_mod. Jun 25 16:31:02.186983 systemd[1]: modprobe@efi_pstore.service: Deactivated successfully. Jun 25 16:31:02.186997 systemd[1]: Finished modprobe@efi_pstore.service - Load Kernel Module efi_pstore. Jun 25 16:31:02.187025 systemd[1]: Finished systemd-network-generator.service - Generate network units from Kernel command line. Jun 25 16:31:02.187037 systemd[1]: Finished systemd-remount-fs.service - Remount Root and Kernel File Systems. Jun 25 16:31:02.187049 systemd[1]: modprobe@configfs.service: Deactivated successfully. Jun 25 16:31:02.187061 systemd[1]: Finished modprobe@configfs.service - Load Kernel Module configfs. Jun 25 16:31:02.187074 systemd[1]: Reached target network-pre.target - Preparation for Network. Jun 25 16:31:02.187086 systemd[1]: Mounting sys-kernel-config.mount - Kernel Configuration File System... Jun 25 16:31:02.187097 kernel: fuse: init (API version 7.37) Jun 25 16:31:02.187108 systemd[1]: remount-root.service - Remount Root File System was skipped because of an unmet condition check (ConditionPathIsReadWrite=!/). Jun 25 16:31:02.187120 systemd[1]: Starting systemd-hwdb-update.service - Rebuild Hardware Database... Jun 25 16:31:02.187131 systemd[1]: systemd-pstore.service - Platform Persistent Storage Archival was skipped because of an unmet condition check (ConditionDirectoryNotEmpty=/sys/fs/pstore). Jun 25 16:31:02.187143 systemd[1]: Starting systemd-random-seed.service - Load/Save Random Seed... Jun 25 16:31:02.187154 systemd[1]: modprobe@fuse.service: Deactivated successfully. Jun 25 16:31:02.187167 systemd[1]: Finished modprobe@fuse.service - Load Kernel Module fuse. Jun 25 16:31:02.187179 systemd[1]: Finished systemd-modules-load.service - Load Kernel Modules. Jun 25 16:31:02.187190 systemd[1]: Mounted sys-kernel-config.mount - Kernel Configuration File System. Jun 25 16:31:02.187202 systemd[1]: Mounting sys-fs-fuse-connections.mount - FUSE Control File System... Jun 25 16:31:02.187213 systemd[1]: Starting systemd-sysctl.service - Apply Kernel Variables... Jun 25 16:31:02.187224 systemd[1]: Mounted sys-fs-fuse-connections.mount - FUSE Control File System. Jun 25 16:31:02.187235 systemd[1]: Finished systemd-random-seed.service - Load/Save Random Seed. Jun 25 16:31:02.187247 systemd[1]: Reached target first-boot-complete.target - First Boot Complete. Jun 25 16:31:02.187293 systemd-journald[978]: Journal started Jun 25 16:31:02.188160 systemd-journald[978]: Runtime Journal (/run/log/journal/267bf8507a58475f96f518889cf2a746) is 4.9M, max 39.3M, 34.4M free. Jun 25 16:31:01.108000 audit: MAC_POLICY_LOAD auid=4294967295 ses=4294967295 lsm=selinux res=1 Jun 25 16:31:02.192373 systemd[1]: Started systemd-journald.service - Journal Service. Jun 25 16:31:01.235000 audit: BPF prog-id=10 op=LOAD Jun 25 16:31:01.235000 audit: BPF prog-id=10 op=UNLOAD Jun 25 16:31:01.235000 audit: BPF prog-id=11 op=LOAD Jun 25 16:31:01.235000 audit: BPF prog-id=11 op=UNLOAD Jun 25 16:31:01.899000 audit: BPF prog-id=12 op=LOAD Jun 25 16:31:01.899000 audit: BPF prog-id=3 op=UNLOAD Jun 25 16:31:01.900000 audit: BPF prog-id=13 op=LOAD Jun 25 16:31:01.900000 audit: BPF prog-id=14 op=LOAD Jun 25 16:31:01.900000 audit: BPF prog-id=4 op=UNLOAD Jun 25 16:31:01.900000 audit: BPF prog-id=5 op=UNLOAD Jun 25 16:31:01.901000 audit: BPF prog-id=15 op=LOAD Jun 25 16:31:01.901000 audit: BPF prog-id=12 op=UNLOAD Jun 25 16:31:01.901000 audit: BPF prog-id=16 op=LOAD Jun 25 16:31:01.901000 audit: BPF prog-id=17 op=LOAD Jun 25 16:31:01.901000 audit: BPF prog-id=13 op=UNLOAD Jun 25 16:31:01.901000 audit: BPF prog-id=14 op=UNLOAD Jun 25 16:31:01.902000 audit: BPF prog-id=18 op=LOAD Jun 25 16:31:01.902000 audit: BPF prog-id=15 op=UNLOAD Jun 25 16:31:01.902000 audit: BPF prog-id=19 op=LOAD Jun 25 16:31:01.902000 audit: BPF prog-id=20 op=LOAD Jun 25 16:31:01.902000 audit: BPF prog-id=16 op=UNLOAD Jun 25 16:31:01.902000 audit: BPF prog-id=17 op=UNLOAD Jun 25 16:31:01.903000 audit[1]: SERVICE_STOP 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' Jun 25 16:31:01.906000 audit[1]: SERVICE_STOP pid=1 uid=0 auid=4294967295 ses=4294967295 subj=system_u:system_r:kernel_t:s0 msg='unit=iscsiuio comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Jun 25 16:31:01.908000 audit[1]: SERVICE_STOP pid=1 uid=0 auid=4294967295 ses=4294967295 subj=system_u:system_r:kernel_t:s0 msg='unit=iscsid comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Jun 25 16:31:01.911000 audit: BPF prog-id=18 op=UNLOAD Jun 25 16:31:01.911000 audit[1]: SERVICE_START pid=1 uid=0 auid=4294967295 ses=4294967295 subj=system_u:system_r:kernel_t:s0 msg='unit=initrd-switch-root comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Jun 25 16:31:01.911000 audit[1]: SERVICE_STOP pid=1 uid=0 auid=4294967295 ses=4294967295 subj=system_u:system_r:kernel_t:s0 msg='unit=initrd-switch-root comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Jun 25 16:31:02.031000 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' Jun 25 16:31:02.036000 audit[1]: SERVICE_STOP pid=1 uid=0 auid=4294967295 ses=4294967295 subj=system_u:system_r:kernel_t:s0 msg='unit=systemd-fsck-usr comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Jun 25 16:31:02.038000 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' Jun 25 16:31:02.038000 audit[1]: SERVICE_STOP 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' Jun 25 16:31:02.039000 audit: BPF prog-id=21 op=LOAD Jun 25 16:31:02.039000 audit: BPF prog-id=22 op=LOAD Jun 25 16:31:02.039000 audit: BPF prog-id=23 op=LOAD Jun 25 16:31:02.046000 audit: BPF prog-id=20 op=UNLOAD Jun 25 16:31:02.046000 audit: BPF prog-id=19 op=UNLOAD Jun 25 16:31:02.068000 audit[1]: SERVICE_STOP pid=1 uid=0 auid=4294967295 ses=4294967295 subj=system_u:system_r:kernel_t:s0 msg='unit=verity-setup comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Jun 25 16:31:02.085000 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' Jun 25 16:31:02.089000 audit[1]: SERVICE_START pid=1 uid=0 auid=4294967295 ses=4294967295 subj=system_u:system_r:kernel_t:s0 msg='unit=modprobe@dm_mod comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Jun 25 16:31:02.089000 audit[1]: SERVICE_STOP pid=1 uid=0 auid=4294967295 ses=4294967295 subj=system_u:system_r:kernel_t:s0 msg='unit=modprobe@dm_mod comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Jun 25 16:31:02.092000 audit[1]: SERVICE_START pid=1 uid=0 auid=4294967295 ses=4294967295 subj=system_u:system_r:kernel_t:s0 msg='unit=modprobe@efi_pstore comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Jun 25 16:31:02.092000 audit[1]: SERVICE_STOP pid=1 uid=0 auid=4294967295 ses=4294967295 subj=system_u:system_r:kernel_t:s0 msg='unit=modprobe@efi_pstore comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Jun 25 16:31:02.095000 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' Jun 25 16:31:02.098000 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' Jun 25 16:31:02.102000 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' Jun 25 16:31:02.102000 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' Jun 25 16:31:02.143000 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' Jun 25 16:31:02.143000 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' Jun 25 16:31:02.146000 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' Jun 25 16:31:02.153000 audit: CONFIG_CHANGE op=set audit_enabled=1 old=1 auid=4294967295 ses=4294967295 subj=system_u:system_r:kernel_t:s0 res=1 Jun 25 16:31:02.153000 audit[978]: SYSCALL arch=c000003e syscall=46 success=yes exit=60 a0=5 a1=7ffdbe907ff0 a2=4000 a3=7ffdbe90808c items=0 ppid=1 pid=978 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) Jun 25 16:31:02.153000 audit: PROCTITLE proctitle="/usr/lib/systemd/systemd-journald" Jun 25 16:31:02.174000 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' Jun 25 16:31:02.189000 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' Jun 25 16:31:02.194000 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' Jun 25 16:31:02.195000 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' Jun 25 16:31:01.890547 systemd[1]: Queued start job for default target multi-user.target. Jun 25 16:31:01.890558 systemd[1]: Unnecessary job was removed for dev-vda6.device - /dev/vda6. Jun 25 16:31:01.903563 systemd[1]: systemd-journald.service: Deactivated successfully. Jun 25 16:31:02.193542 systemd[1]: Starting systemd-journal-flush.service - Flush Journal to Persistent Storage... Jun 25 16:31:02.194520 systemd[1]: Finished systemd-udev-trigger.service - Coldplug All udev Devices. Jun 25 16:31:02.195427 systemd[1]: Finished systemd-sysctl.service - Apply Kernel Variables. Jun 25 16:31:02.197473 systemd[1]: Starting systemd-udev-settle.service - Wait for udev To Complete Device Initialization... Jun 25 16:31:02.208136 udevadm[998]: systemd-udev-settle.service is deprecated. Please fix lvm2-activation.service, lvm2-activation-early.service not to pull it in. Jun 25 16:31:02.209103 systemd-journald[978]: Time spent on flushing to /var/log/journal/267bf8507a58475f96f518889cf2a746 is 32.539ms for 1030 entries. Jun 25 16:31:02.209103 systemd-journald[978]: System Journal (/var/log/journal/267bf8507a58475f96f518889cf2a746) is 8.0M, max 584.8M, 576.8M free. Jun 25 16:31:02.251540 systemd-journald[978]: Received client request to flush runtime journal. Jun 25 16:31:02.251592 kernel: loop: module loaded Jun 25 16:31:02.215000 audit[1]: SERVICE_START pid=1 uid=0 auid=4294967295 ses=4294967295 subj=system_u:system_r:kernel_t:s0 msg='unit=modprobe@loop comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Jun 25 16:31:02.215000 audit[1]: SERVICE_STOP pid=1 uid=0 auid=4294967295 ses=4294967295 subj=system_u:system_r:kernel_t:s0 msg='unit=modprobe@loop comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Jun 25 16:31:02.214756 systemd[1]: modprobe@loop.service: Deactivated successfully. Jun 25 16:31:02.214909 systemd[1]: Finished modprobe@loop.service - Load Kernel Module loop. Jun 25 16:31:02.215653 systemd[1]: systemd-repart.service - Repartition Root Disk was skipped because no trigger condition checks were met. Jun 25 16:31:02.260686 kernel: ACPI: bus type drm_connector registered Jun 25 16:31:02.257000 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' Jun 25 16:31:02.257470 systemd[1]: Finished systemd-journal-flush.service - Flush Journal to Persistent Storage. Jun 25 16:31:02.261000 systemd[1]: modprobe@drm.service: Deactivated successfully. Jun 25 16:31:02.261144 systemd[1]: Finished modprobe@drm.service - Load Kernel Module drm. Jun 25 16:31:02.261000 audit[1]: SERVICE_START pid=1 uid=0 auid=4294967295 ses=4294967295 subj=system_u:system_r:kernel_t:s0 msg='unit=modprobe@drm comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Jun 25 16:31:02.261000 audit[1]: SERVICE_STOP pid=1 uid=0 auid=4294967295 ses=4294967295 subj=system_u:system_r:kernel_t:s0 msg='unit=modprobe@drm comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Jun 25 16:31:02.281773 systemd[1]: Finished flatcar-tmpfiles.service - Create missing system files. Jun 25 16:31:02.281000 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' Jun 25 16:31:02.286604 systemd[1]: Starting systemd-sysusers.service - Create System Users... Jun 25 16:31:02.313675 systemd[1]: Finished systemd-sysusers.service - Create System Users. Jun 25 16:31:02.313000 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' Jun 25 16:31:02.863009 systemd[1]: Finished systemd-hwdb-update.service - Rebuild Hardware Database. Jun 25 16:31:02.863000 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' Jun 25 16:31:02.865000 audit: BPF prog-id=24 op=LOAD Jun 25 16:31:02.865000 audit: BPF prog-id=25 op=LOAD Jun 25 16:31:02.865000 audit: BPF prog-id=7 op=UNLOAD Jun 25 16:31:02.865000 audit: BPF prog-id=8 op=UNLOAD Jun 25 16:31:02.868928 systemd[1]: Starting systemd-udevd.service - Rule-based Manager for Device Events and Files... Jun 25 16:31:02.921359 systemd-udevd[1019]: Using default interface naming scheme 'v252'. Jun 25 16:31:02.971000 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' Jun 25 16:31:02.973000 audit: BPF prog-id=26 op=LOAD Jun 25 16:31:02.970707 systemd[1]: Started systemd-udevd.service - Rule-based Manager for Device Events and Files. Jun 25 16:31:02.980749 systemd[1]: Starting systemd-networkd.service - Network Configuration... Jun 25 16:31:02.994000 audit: BPF prog-id=27 op=LOAD Jun 25 16:31:02.995000 audit: BPF prog-id=28 op=LOAD Jun 25 16:31:02.995000 audit: BPF prog-id=29 op=LOAD Jun 25 16:31:03.001696 systemd[1]: Starting systemd-userdbd.service - User Database Manager... Jun 25 16:31:03.026452 kernel: BTRFS info: devid 1 device path /dev/mapper/usr changed to /dev/dm-0 scanned by (udev-worker) (1020) Jun 25 16:31:03.030583 systemd[1]: Condition check resulted in dev-ttyS0.device - /dev/ttyS0 being skipped. Jun 25 16:31:03.069000 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' Jun 25 16:31:03.069057 systemd[1]: Started systemd-userdbd.service - User Database Manager. Jun 25 16:31:03.102444 kernel: BTRFS warning: duplicate device /dev/vda3 devid 1 generation 33 scanned by (udev-worker) (1032) Jun 25 16:31:03.137427 kernel: input: Power Button as /devices/LNXSYSTM:00/LNXPWRBN:00/input/input2 Jun 25 16:31:03.152467 kernel: ACPI: button: Power Button [PWRF] Jun 25 16:31:03.151000 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' Jun 25 16:31:03.151018 systemd-networkd[1026]: lo: Link UP Jun 25 16:31:03.151023 systemd-networkd[1026]: lo: Gained carrier Jun 25 16:31:03.151483 systemd-networkd[1026]: Enumeration completed Jun 25 16:31:03.151719 systemd[1]: Started systemd-networkd.service - Network Configuration. Jun 25 16:31:03.152276 systemd-networkd[1026]: eth0: found matching network '/usr/lib/systemd/network/zz-default.network', based on potentially unpredictable interface name. Jun 25 16:31:03.152280 systemd-networkd[1026]: eth0: Configuring with /usr/lib/systemd/network/zz-default.network. Jun 25 16:31:03.153793 systemd-networkd[1026]: eth0: Link UP Jun 25 16:31:03.153872 systemd-networkd[1026]: eth0: Gained carrier Jun 25 16:31:03.153934 systemd-networkd[1026]: eth0: found matching network '/usr/lib/systemd/network/zz-default.network', based on potentially unpredictable interface name. Jun 25 16:31:03.157623 systemd[1]: Starting systemd-networkd-wait-online.service - Wait for Network to be Configured... Jun 25 16:31:03.165548 systemd-networkd[1026]: eth0: DHCPv4 address 172.24.4.212/24, gateway 172.24.4.1 acquired from 172.24.4.1 Jun 25 16:31:03.187434 kernel: piix4_smbus 0000:00:01.3: SMBus Host Controller at 0x700, revision 0 Jun 25 16:31:03.216759 systemd[1]: Found device dev-disk-by\x2dlabel-OEM.device - /dev/disk/by-label/OEM. Jun 25 16:31:03.238436 kernel: input: ImExPS/2 Generic Explorer Mouse as /devices/platform/i8042/serio1/input/input3 Jun 25 16:31:03.243409 kernel: mousedev: PS/2 mouse device common for all mice Jun 25 16:31:03.271431 kernel: [drm] pci: virtio-vga detected at 0000:00:02.0 Jun 25 16:31:03.271510 kernel: virtio-pci 0000:00:02.0: vgaarb: deactivate vga console Jun 25 16:31:03.285870 kernel: Console: switching to colour dummy device 80x25 Jun 25 16:31:03.287074 kernel: [drm] features: -virgl +edid -resource_blob -host_visible Jun 25 16:31:03.287111 kernel: [drm] features: -context_init Jun 25 16:31:03.289408 kernel: [drm] number of scanouts: 1 Jun 25 16:31:03.289454 kernel: [drm] number of cap sets: 0 Jun 25 16:31:03.294448 kernel: [drm] Initialized virtio_gpu 0.1.0 0 for 0000:00:02.0 on minor 0 Jun 25 16:31:03.300110 kernel: fbcon: virtio_gpudrmfb (fb0) is primary device Jun 25 16:31:03.300168 kernel: virtio-pci 0000:00:02.0: [drm] drm_plane_enable_fb_damage_clips() not called Jun 25 16:31:03.300337 kernel: Console: switching to colour frame buffer device 128x48 Jun 25 16:31:03.305802 kernel: virtio-pci 0000:00:02.0: [drm] fb0: virtio_gpudrmfb frame buffer device Jun 25 16:31:03.317101 systemd[1]: Finished systemd-udev-settle.service - Wait for udev To Complete Device Initialization. Jun 25 16:31:03.316000 audit[1]: SERVICE_START pid=1 uid=0 auid=4294967295 ses=4294967295 subj=system_u:system_r:kernel_t:s0 msg='unit=systemd-udev-settle comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Jun 25 16:31:03.320571 systemd[1]: Starting lvm2-activation-early.service - Activation of LVM2 logical volumes... Jun 25 16:31:03.334842 lvm[1052]: WARNING: Failed to connect to lvmetad. Falling back to device scanning. Jun 25 16:31:03.365984 systemd[1]: Finished lvm2-activation-early.service - Activation of LVM2 logical volumes. Jun 25 16:31:03.366000 audit[1]: SERVICE_START pid=1 uid=0 auid=4294967295 ses=4294967295 subj=system_u:system_r:kernel_t:s0 msg='unit=lvm2-activation-early comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Jun 25 16:31:03.367104 systemd[1]: Reached target cryptsetup.target - Local Encrypted Volumes. Jun 25 16:31:03.379728 systemd[1]: Starting lvm2-activation.service - Activation of LVM2 logical volumes... Jun 25 16:31:03.383629 lvm[1053]: WARNING: Failed to connect to lvmetad. Falling back to device scanning. Jun 25 16:31:03.414671 systemd[1]: Finished lvm2-activation.service - Activation of LVM2 logical volumes. Jun 25 16:31:03.415000 audit[1]: SERVICE_START pid=1 uid=0 auid=4294967295 ses=4294967295 subj=system_u:system_r:kernel_t:s0 msg='unit=lvm2-activation comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Jun 25 16:31:03.416363 systemd[1]: Reached target local-fs-pre.target - Preparation for Local File Systems. Jun 25 16:31:03.417621 systemd[1]: var-lib-machines.mount - Virtual Machine and Container Storage (Compatibility) was skipped because of an unmet condition check (ConditionPathExists=/var/lib/machines.raw). Jun 25 16:31:03.417698 systemd[1]: Reached target local-fs.target - Local File Systems. Jun 25 16:31:03.418846 systemd[1]: Reached target machines.target - Containers. Jun 25 16:31:03.426726 systemd[1]: Starting ldconfig.service - Rebuild Dynamic Linker Cache... Jun 25 16:31:03.429254 systemd[1]: systemd-binfmt.service - Set Up Additional Binary Formats was skipped because no trigger condition checks were met. Jun 25 16:31:03.429374 systemd[1]: systemd-boot-system-token.service - Store a System Token in an EFI Variable was skipped because of an unmet condition check (ConditionPathExists=/sys/firmware/efi/efivars/LoaderFeatures-4a67b082-0a4c-41cf-b6c7-440b29bb8c4f). Jun 25 16:31:03.432605 systemd[1]: Starting systemd-boot-update.service - Automatic Boot Loader Update... Jun 25 16:31:03.435518 systemd[1]: Starting systemd-fsck@dev-disk-by\x2dlabel-OEM.service - File System Check on /dev/disk/by-label/OEM... Jun 25 16:31:03.437178 systemd[1]: Starting systemd-machine-id-commit.service - Commit a transient machine-id on disk... Jun 25 16:31:03.439150 systemd[1]: Starting systemd-sysext.service - Merge System Extension Images into /usr/ and /opt/... Jun 25 16:31:03.451506 systemd[1]: boot.automount: Got automount request for /boot, triggered by 1055 (bootctl) Jun 25 16:31:03.456545 systemd[1]: Starting systemd-fsck@dev-disk-by\x2dlabel-EFI\x2dSYSTEM.service - File System Check on /dev/disk/by-label/EFI-SYSTEM... Jun 25 16:31:03.483471 kernel: loop0: detected capacity change from 0 to 80584 Jun 25 16:31:03.494271 systemd[1]: Finished systemd-fsck@dev-disk-by\x2dlabel-OEM.service - File System Check on /dev/disk/by-label/OEM. Jun 25 16:31:03.494000 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' Jun 25 16:31:03.521000 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' Jun 25 16:31:03.520041 systemd[1]: etc-machine\x2did.mount: Deactivated successfully. Jun 25 16:31:03.521436 systemd[1]: Finished systemd-machine-id-commit.service - Commit a transient machine-id on disk. Jun 25 16:31:03.575518 kernel: squashfs: version 4.0 (2009/01/31) Phillip Lougher Jun 25 16:31:03.603438 kernel: loop1: detected capacity change from 0 to 8 Jun 25 16:31:03.621447 kernel: loop2: detected capacity change from 0 to 139360 Jun 25 16:31:03.671329 kernel: loop3: detected capacity change from 0 to 80584 Jun 25 16:31:03.671600 systemd-fsck[1062]: fsck.fat 4.2 (2021-01-31) Jun 25 16:31:03.671600 systemd-fsck[1062]: /dev/vda1: 808 files, 120378/258078 clusters Jun 25 16:31:03.671797 systemd[1]: Finished systemd-fsck@dev-disk-by\x2dlabel-EFI\x2dSYSTEM.service - File System Check on /dev/disk/by-label/EFI-SYSTEM. Jun 25 16:31:03.674000 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-EFI\x2dSYSTEM comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Jun 25 16:31:03.681658 systemd[1]: Mounting boot.mount - Boot partition... Jun 25 16:31:03.708825 systemd[1]: Mounted boot.mount - Boot partition. Jun 25 16:31:03.718444 kernel: loop4: detected capacity change from 0 to 8 Jun 25 16:31:03.724429 kernel: loop5: detected capacity change from 0 to 139360 Jun 25 16:31:03.745000 audit[1]: SERVICE_START pid=1 uid=0 auid=4294967295 ses=4294967295 subj=system_u:system_r:kernel_t:s0 msg='unit=systemd-boot-update comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Jun 25 16:31:03.745655 systemd[1]: Finished systemd-boot-update.service - Automatic Boot Loader Update. Jun 25 16:31:03.754075 (sd-sysext)[1067]: Using extensions 'containerd-flatcar', 'docker-flatcar', 'oem-openstack'. Jun 25 16:31:03.755083 (sd-sysext)[1067]: Merged extensions into '/usr'. Jun 25 16:31:03.756617 systemd[1]: Finished systemd-sysext.service - Merge System Extension Images into /usr/ and /opt/. Jun 25 16:31:03.756000 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' Jun 25 16:31:03.763825 systemd[1]: Starting ensure-sysext.service... Jun 25 16:31:03.769434 systemd[1]: Starting systemd-tmpfiles-setup.service - Create Volatile Files and Directories... Jun 25 16:31:03.786666 systemd-tmpfiles[1071]: /usr/lib/tmpfiles.d/legacy.conf:13: Duplicate line for path "/run/lock", ignoring. Jun 25 16:31:03.787689 systemd[1]: Reloading. Jun 25 16:31:03.792763 systemd-tmpfiles[1071]: /usr/lib/tmpfiles.d/provision.conf:20: Duplicate line for path "/root", ignoring. Jun 25 16:31:03.800111 systemd-tmpfiles[1071]: /usr/lib/tmpfiles.d/systemd-flatcar.conf:6: Duplicate line for path "/var/log/journal", ignoring. Jun 25 16:31:03.825914 systemd-tmpfiles[1071]: /usr/lib/tmpfiles.d/systemd.conf:29: Duplicate line for path "/var/lib/systemd", ignoring. Jun 25 16:31:04.003046 systemd[1]: /usr/lib/systemd/system/docker.socket:6: ListenStream= references a path below legacy directory /var/run/, updating /var/run/docker.sock → /run/docker.sock; please update the unit file accordingly. Jun 25 16:31:04.097000 audit: BPF prog-id=30 op=LOAD Jun 25 16:31:04.097000 audit: BPF prog-id=27 op=UNLOAD Jun 25 16:31:04.097000 audit: BPF prog-id=31 op=LOAD Jun 25 16:31:04.097000 audit: BPF prog-id=32 op=LOAD Jun 25 16:31:04.097000 audit: BPF prog-id=28 op=UNLOAD Jun 25 16:31:04.097000 audit: BPF prog-id=29 op=UNLOAD Jun 25 16:31:04.098000 audit: BPF prog-id=33 op=LOAD Jun 25 16:31:04.098000 audit: BPF prog-id=34 op=LOAD Jun 25 16:31:04.098000 audit: BPF prog-id=24 op=UNLOAD Jun 25 16:31:04.098000 audit: BPF prog-id=25 op=UNLOAD Jun 25 16:31:04.099000 audit: BPF prog-id=35 op=LOAD Jun 25 16:31:04.099000 audit: BPF prog-id=26 op=UNLOAD Jun 25 16:31:04.101000 audit: BPF prog-id=36 op=LOAD Jun 25 16:31:04.101000 audit: BPF prog-id=21 op=UNLOAD Jun 25 16:31:04.101000 audit: BPF prog-id=37 op=LOAD Jun 25 16:31:04.101000 audit: BPF prog-id=38 op=LOAD Jun 25 16:31:04.101000 audit: BPF prog-id=22 op=UNLOAD Jun 25 16:31:04.101000 audit: BPF prog-id=23 op=UNLOAD Jun 25 16:31:04.118080 systemd[1]: Finished systemd-tmpfiles-setup.service - Create Volatile Files and Directories. Jun 25 16:31:04.128000 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' Jun 25 16:31:04.140991 systemd[1]: Starting audit-rules.service - Load Security Auditing Rules... Jun 25 16:31:04.166989 systemd[1]: Starting clean-ca-certificates.service - Clean up broken links in /etc/ssl/certs... Jun 25 16:31:04.173000 audit: BPF prog-id=39 op=LOAD Jun 25 16:31:04.171911 systemd[1]: Starting systemd-journal-catalog-update.service - Rebuild Journal Catalog... Jun 25 16:31:04.176848 systemd[1]: Starting systemd-resolved.service - Network Name Resolution... Jun 25 16:31:04.183000 audit: BPF prog-id=40 op=LOAD Jun 25 16:31:04.190784 systemd[1]: Starting systemd-timesyncd.service - Network Time Synchronization... Jun 25 16:31:04.194964 systemd[1]: Starting systemd-update-utmp.service - Record System Boot/Shutdown in UTMP... Jun 25 16:31:04.200000 audit[1150]: SYSTEM_BOOT pid=1150 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' Jun 25 16:31:04.201444 systemd-networkd[1026]: eth0: Gained IPv6LL Jun 25 16:31:04.208554 systemd[1]: Finished systemd-networkd-wait-online.service - Wait for Network to be Configured. Jun 25 16:31:04.218000 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' Jun 25 16:31:04.220483 systemd[1]: proc-xen.mount - /proc/xen was skipped because of an unmet condition check (ConditionVirtualization=xen). Jun 25 16:31:04.220860 systemd[1]: ignition-delete-config.service - Ignition (delete config) was skipped because no trigger condition checks were met. Jun 25 16:31:04.225937 systemd[1]: Starting modprobe@dm_mod.service - Load Kernel Module dm_mod... Jun 25 16:31:04.228460 ldconfig[1054]: /sbin/ldconfig: /lib/ld.so.conf is not an ELF file - it has the wrong magic bytes at the start. Jun 25 16:31:04.233291 systemd[1]: Starting modprobe@efi_pstore.service - Load Kernel Module efi_pstore... Jun 25 16:31:04.246711 systemd[1]: Starting modprobe@loop.service - Load Kernel Module loop... Jun 25 16:31:04.247528 systemd[1]: systemd-binfmt.service - Set Up Additional Binary Formats was skipped because no trigger condition checks were met. Jun 25 16:31:04.247680 systemd[1]: systemd-boot-system-token.service - Store a System Token in an EFI Variable was skipped because of an unmet condition check (ConditionPathExists=/sys/firmware/efi/efivars/LoaderFeatures-4a67b082-0a4c-41cf-b6c7-440b29bb8c4f). Jun 25 16:31:04.247833 systemd[1]: xenserver-pv-version.service - Set fake PV driver version for XenServer was skipped because of an unmet condition check (ConditionVirtualization=xen). Jun 25 16:31:04.252180 systemd[1]: Finished ldconfig.service - Rebuild Dynamic Linker Cache. Jun 25 16:31:04.256575 augenrules[1157]: No rules Jun 25 16:31:04.256000 audit: CONFIG_CHANGE auid=4294967295 ses=4294967295 subj=system_u:system_r:kernel_t:s0 op=add_rule key=(null) list=5 res=1 Jun 25 16:31:04.256000 audit[1157]: SYSCALL arch=c000003e syscall=44 success=yes exit=1056 a0=3 a1=7ffeb58b4f00 a2=420 a3=0 items=0 ppid=1134 pid=1157 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/sbin/auditctl" subj=system_u:system_r:kernel_t:s0 key=(null) Jun 25 16:31:04.256000 audit: PROCTITLE proctitle=2F7362696E2F617564697463746C002D52002F6574632F61756469742F61756469742E72756C6573 Jun 25 16:31:04.257259 systemd[1]: Finished systemd-journal-catalog-update.service - Rebuild Journal Catalog. Jun 25 16:31:04.260005 systemd[1]: Finished audit-rules.service - Load Security Auditing Rules. Jun 25 16:31:04.264181 systemd[1]: Finished systemd-update-utmp.service - Record System Boot/Shutdown in UTMP. Jun 25 16:31:04.265093 systemd[1]: modprobe@dm_mod.service: Deactivated successfully. Jun 25 16:31:04.265210 systemd[1]: Finished modprobe@dm_mod.service - Load Kernel Module dm_mod. Jun 25 16:31:04.266048 systemd[1]: modprobe@efi_pstore.service: Deactivated successfully. Jun 25 16:31:04.266162 systemd[1]: Finished modprobe@efi_pstore.service - Load Kernel Module efi_pstore. Jun 25 16:31:04.266937 systemd[1]: modprobe@loop.service: Deactivated successfully. Jun 25 16:31:04.267049 systemd[1]: Finished modprobe@loop.service - Load Kernel Module loop. Jun 25 16:31:04.274121 systemd[1]: proc-xen.mount - /proc/xen was skipped because of an unmet condition check (ConditionVirtualization=xen). Jun 25 16:31:04.274348 systemd[1]: ignition-delete-config.service - Ignition (delete config) was skipped because no trigger condition checks were met. Jun 25 16:31:04.281649 systemd[1]: Starting modprobe@dm_mod.service - Load Kernel Module dm_mod... Jun 25 16:31:04.293704 systemd[1]: Starting modprobe@efi_pstore.service - Load Kernel Module efi_pstore... Jun 25 16:31:04.295724 systemd[1]: Starting modprobe@loop.service - Load Kernel Module loop... Jun 25 16:31:04.296257 systemd[1]: systemd-binfmt.service - Set Up Additional Binary Formats was skipped because no trigger condition checks were met. Jun 25 16:31:04.298231 systemd[1]: systemd-boot-system-token.service - Store a System Token in an EFI Variable was skipped because of an unmet condition check (ConditionPathExists=/sys/firmware/efi/efivars/LoaderFeatures-4a67b082-0a4c-41cf-b6c7-440b29bb8c4f). Jun 25 16:31:04.300210 systemd[1]: Starting systemd-update-done.service - Update is Completed... Jun 25 16:31:04.303976 systemd[1]: xenserver-pv-version.service - Set fake PV driver version for XenServer was skipped because of an unmet condition check (ConditionVirtualization=xen). Jun 25 16:31:04.305232 systemd[1]: modprobe@dm_mod.service: Deactivated successfully. Jun 25 16:31:04.305405 systemd[1]: Finished modprobe@dm_mod.service - Load Kernel Module dm_mod. Jun 25 16:31:04.318422 systemd[1]: Finished systemd-update-done.service - Update is Completed. Jun 25 16:31:04.325836 systemd[1]: Finished clean-ca-certificates.service - Clean up broken links in /etc/ssl/certs. Jun 25 16:31:04.330137 systemd[1]: proc-xen.mount - /proc/xen was skipped because of an unmet condition check (ConditionVirtualization=xen). Jun 25 16:31:04.330371 systemd[1]: ignition-delete-config.service - Ignition (delete config) was skipped because no trigger condition checks were met. Jun 25 16:31:04.336543 systemd[1]: Starting modprobe@dm_mod.service - Load Kernel Module dm_mod... Jun 25 16:31:04.344538 systemd[1]: Starting modprobe@drm.service - Load Kernel Module drm... Jun 25 16:31:04.345245 systemd[1]: systemd-binfmt.service - Set Up Additional Binary Formats was skipped because no trigger condition checks were met. Jun 25 16:31:04.345315 systemd[1]: systemd-boot-system-token.service - Store a System Token in an EFI Variable was skipped because of an unmet condition check (ConditionPathExists=/sys/firmware/efi/efivars/LoaderFeatures-4a67b082-0a4c-41cf-b6c7-440b29bb8c4f). Jun 25 16:31:04.345418 systemd[1]: update-ca-certificates.service - Update CA bundle at /etc/ssl/certs/ca-certificates.crt was skipped because of an unmet condition check (ConditionPathIsSymbolicLink=!/etc/ssl/certs/ca-certificates.crt). Jun 25 16:31:04.345459 systemd[1]: xenserver-pv-version.service - Set fake PV driver version for XenServer was skipped because of an unmet condition check (ConditionVirtualization=xen). Jun 25 16:31:04.349550 systemd[1]: Finished ensure-sysext.service. Jun 25 16:31:04.350513 systemd[1]: modprobe@loop.service: Deactivated successfully. Jun 25 16:31:04.350657 systemd[1]: Finished modprobe@loop.service - Load Kernel Module loop. Jun 25 16:31:04.351291 systemd[1]: modprobe@dm_mod.service: Deactivated successfully. Jun 25 16:31:04.351423 systemd[1]: Finished modprobe@dm_mod.service - Load Kernel Module dm_mod. Jun 25 16:31:04.352018 systemd[1]: modprobe@drm.service: Deactivated successfully. Jun 25 16:31:04.352129 systemd[1]: Finished modprobe@drm.service - Load Kernel Module drm. Jun 25 16:31:04.355743 systemd[1]: Started systemd-timesyncd.service - Network Time Synchronization. Jun 25 16:31:04.357748 systemd[1]: modprobe@efi_pstore.service: Deactivated successfully. Jun 25 16:31:04.357903 systemd[1]: Finished modprobe@efi_pstore.service - Load Kernel Module efi_pstore. Jun 25 16:31:04.358480 systemd[1]: Reached target time-set.target - System Time Set. Jun 25 16:31:04.358865 systemd[1]: systemd-pstore.service - Platform Persistent Storage Archival was skipped because of an unmet condition check (ConditionDirectoryNotEmpty=/sys/fs/pstore). Jun 25 16:31:04.358934 systemd[1]: systemd-repart.service - Repartition Root Disk was skipped because no trigger condition checks were met. Jun 25 16:31:04.378229 systemd-timesyncd[1147]: Contacted time server 95.81.173.74:123 (0.flatcar.pool.ntp.org). Jun 25 16:31:04.378540 systemd-timesyncd[1147]: Initial clock synchronization to Tue 2024-06-25 16:31:04.392009 UTC. Jun 25 16:31:04.378635 systemd-resolved[1144]: Positive Trust Anchors: Jun 25 16:31:04.378654 systemd-resolved[1144]: . IN DS 20326 8 2 e06d44b80b8f1d39a95c0b0d7c65d08458e880409bbc683457104237c7f8ec8d Jun 25 16:31:04.378693 systemd-resolved[1144]: 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 168.192.in-addr.arpa d.f.ip6.arpa corp home internal intranet lan local private test Jun 25 16:31:04.383518 systemd-resolved[1144]: Using system hostname 'ci-3815-2-4-1-fc28402a5e.novalocal'. Jun 25 16:31:04.384998 systemd[1]: Started systemd-resolved.service - Network Name Resolution. Jun 25 16:31:04.385637 systemd[1]: Reached target network.target - Network. Jun 25 16:31:04.386049 systemd[1]: Reached target network-online.target - Network is Online. Jun 25 16:31:04.386467 systemd[1]: Reached target nss-lookup.target - Host and Network Name Lookups. Jun 25 16:31:04.386837 systemd[1]: Reached target sysinit.target - System Initialization. Jun 25 16:31:04.387286 systemd[1]: Started motdgen.path - Watch for update engine configuration changes. Jun 25 16:31:04.387697 systemd[1]: Started user-cloudinit@var-lib-flatcar\x2dinstall-user_data.path - Watch for a cloud-config at /var/lib/flatcar-install/user_data. Jun 25 16:31:04.388216 systemd[1]: Started logrotate.timer - Daily rotation of log files. Jun 25 16:31:04.390439 systemd[1]: Started mdadm.timer - Weekly check for MD array's redundancy information.. Jun 25 16:31:04.390876 systemd[1]: Started systemd-tmpfiles-clean.timer - Daily Cleanup of Temporary Directories. Jun 25 16:31:04.391266 systemd[1]: update-engine-stub.timer - Update Engine Stub Timer was skipped because of an unmet condition check (ConditionPathExists=/usr/.noupdate). Jun 25 16:31:04.391297 systemd[1]: Reached target paths.target - Path Units. Jun 25 16:31:04.391688 systemd[1]: Reached target timers.target - Timer Units. Jun 25 16:31:04.392446 systemd[1]: Listening on dbus.socket - D-Bus System Message Bus Socket. Jun 25 16:31:04.394458 systemd[1]: Starting docker.socket - Docker Socket for the API... Jun 25 16:31:04.403771 systemd[1]: Listening on sshd.socket - OpenSSH Server Socket. Jun 25 16:31:04.411097 systemd[1]: systemd-pcrphase-sysinit.service - TPM2 PCR Barrier (Initialization) was skipped because of an unmet condition check (ConditionPathExists=/sys/firmware/efi/efivars/StubPcrKernelImage-4a67b082-0a4c-41cf-b6c7-440b29bb8c4f). Jun 25 16:31:04.412893 systemd[1]: Listening on docker.socket - Docker Socket for the API. Jun 25 16:31:04.414088 systemd[1]: Reached target sockets.target - Socket Units. Jun 25 16:31:04.414579 systemd[1]: Reached target basic.target - Basic System. Jun 25 16:31:04.415053 systemd[1]: addon-config@oem.service - Configure Addon /oem was skipped because no trigger condition checks were met. Jun 25 16:31:04.415081 systemd[1]: addon-run@oem.service - Run Addon /oem was skipped because no trigger condition checks were met. Jun 25 16:31:04.422530 systemd[1]: Starting containerd.service - containerd container runtime... Jun 25 16:31:04.424643 systemd[1]: Starting coreos-metadata.service - Flatcar Metadata Agent... Jun 25 16:31:04.426402 systemd[1]: Starting dbus.service - D-Bus System Message Bus... Jun 25 16:31:04.431331 systemd[1]: Starting enable-oem-cloudinit.service - Enable cloudinit... Jun 25 16:31:04.435430 systemd[1]: Starting extend-filesystems.service - Extend Filesystems... Jun 25 16:31:04.435955 systemd[1]: flatcar-setup-environment.service - Modifies /etc/environment for CoreOS was skipped because of an unmet condition check (ConditionPathExists=/oem/bin/flatcar-setup-environment). Jun 25 16:31:04.448644 jq[1176]: true Jun 25 16:31:04.446613 systemd[1]: Starting motdgen.service - Generate /run/flatcar/motd... Jun 25 16:31:04.449869 systemd[1]: Starting nvidia.service - NVIDIA Configure Service... Jun 25 16:31:04.458032 systemd[1]: Starting ssh-key-proc-cmdline.service - Install an ssh key from /proc/cmdline... Jun 25 16:31:04.470573 systemd[1]: Starting sshd-keygen.service - Generate sshd host keys... Jun 25 16:31:04.475441 extend-filesystems[1177]: Found loop3 Jun 25 16:31:04.475441 extend-filesystems[1177]: Found loop4 Jun 25 16:31:04.475441 extend-filesystems[1177]: Found loop5 Jun 25 16:31:04.475441 extend-filesystems[1177]: Found vda Jun 25 16:31:04.491100 extend-filesystems[1177]: Found vda1 Jun 25 16:31:04.491100 extend-filesystems[1177]: Found vda2 Jun 25 16:31:04.491100 extend-filesystems[1177]: Found vda3 Jun 25 16:31:04.491100 extend-filesystems[1177]: Found usr Jun 25 16:31:04.491100 extend-filesystems[1177]: Found vda4 Jun 25 16:31:04.491100 extend-filesystems[1177]: Found vda6 Jun 25 16:31:04.491100 extend-filesystems[1177]: Found vda7 Jun 25 16:31:04.491100 extend-filesystems[1177]: Found vda9 Jun 25 16:31:04.491100 extend-filesystems[1177]: Checking size of /dev/vda9 Jun 25 16:31:04.475858 systemd[1]: Starting systemd-logind.service - User Login Management... Jun 25 16:31:04.485767 systemd[1]: systemd-pcrphase.service - TPM2 PCR Barrier (User) was skipped because of an unmet condition check (ConditionPathExists=/sys/firmware/efi/efivars/StubPcrKernelImage-4a67b082-0a4c-41cf-b6c7-440b29bb8c4f). Jun 25 16:31:04.485834 systemd[1]: tcsd.service - TCG Core Services Daemon was skipped because of an unmet condition check (ConditionPathExists=/dev/tpm0). Jun 25 16:31:04.486344 systemd[1]: cgroup compatibility translation between legacy and unified hierarchy settings activated. See cgroup-compat debug messages for details. Jun 25 16:31:04.525373 jq[1195]: false Jun 25 16:31:04.491595 systemd[1]: Starting update-engine.service - Update Engine... Jun 25 16:31:04.501626 systemd[1]: Starting update-ssh-keys-after-ignition.service - Run update-ssh-keys once after Ignition... Jun 25 16:31:04.505568 systemd[1]: ssh-key-proc-cmdline.service: Deactivated successfully. Jun 25 16:31:04.505776 systemd[1]: Finished ssh-key-proc-cmdline.service - Install an ssh key from /proc/cmdline. Jun 25 16:31:04.537722 jq[1197]: true Jun 25 16:31:04.536259 systemd[1]: update-ssh-keys-after-ignition.service: Skipped due to 'exec-condition'. Jun 25 16:31:04.536447 systemd[1]: Condition check resulted in update-ssh-keys-after-ignition.service - Run update-ssh-keys once after Ignition being skipped. Jun 25 16:31:04.546638 update_engine[1191]: I0625 16:31:04.546329 1191 main.cc:92] Flatcar Update Engine starting Jun 25 16:31:04.578017 update_engine[1191]: I0625 16:31:04.551549 1191 update_check_scheduler.cc:74] Next update check in 5m49s Jun 25 16:31:04.578062 extend-filesystems[1177]: Resized partition /dev/vda9 Jun 25 16:31:04.621876 kernel: BTRFS warning: duplicate device /dev/vda3 devid 1 generation 33 scanned by (udev-worker) (1020) Jun 25 16:31:04.548953 systemd[1]: Starting sshkeys.service... Jun 25 16:31:04.548790 dbus-daemon[1173]: [system] SELinux support is enabled Jun 25 16:31:04.624166 extend-filesystems[1209]: resize2fs 1.47.0 (5-Feb-2023) Jun 25 16:31:04.653047 kernel: EXT4-fs (vda9): resizing filesystem from 1617920 to 4635643 blocks Jun 25 16:31:04.549669 systemd[1]: Started dbus.service - D-Bus System Message Bus. Jun 25 16:31:04.580744 systemd[1]: motdgen.service: Deactivated successfully. Jun 25 16:31:04.580934 systemd[1]: Finished motdgen.service - Generate /run/flatcar/motd. Jun 25 16:31:04.604800 systemd[1]: Finished nvidia.service - NVIDIA Configure Service. Jun 25 16:31:04.625057 systemd[1]: Started update-engine.service - Update Engine. Jun 25 16:31:04.643012 systemd-logind[1188]: New seat seat0. Jun 25 16:31:04.654997 systemd-logind[1188]: Watching system buttons on /dev/input/event1 (Power Button) Jun 25 16:31:04.655240 systemd-logind[1188]: Watching system buttons on /dev/input/event0 (AT Translated Set 2 keyboard) Jun 25 16:31:04.659860 systemd[1]: Created slice system-coreos\x2dmetadata\x2dsshkeys.slice - Slice /system/coreos-metadata-sshkeys. Jun 25 16:31:04.664926 systemctl[1201]: Created symlink /etc/systemd/system/multi-user.target.wants/oem-cloudinit.service → /usr/lib/systemd/system/oem-cloudinit.service. Jun 25 16:31:04.668652 systemd[1]: Starting coreos-metadata-sshkeys@core.service - Flatcar Metadata Agent (SSH Keys)... Jun 25 16:31:04.669294 systemd[1]: system-cloudinit@usr-share-oem-cloud\x2dconfig.yml.service - Load cloud-config from /usr/share/oem/cloud-config.yml was skipped because of an unmet condition check (ConditionFileNotEmpty=/usr/share/oem/cloud-config.yml). Jun 25 16:31:04.669627 systemd[1]: Reached target system-config.target - Load system-provided cloud configs. Jun 25 16:31:04.670175 systemd[1]: user-cloudinit-proc-cmdline.service - Load cloud-config from url defined in /proc/cmdline was skipped because of an unmet condition check (ConditionKernelCommandLine=cloud-config-url). Jun 25 16:31:04.670436 systemd[1]: Reached target user-config.target - Load user-provided cloud configs. Jun 25 16:31:04.677715 systemd[1]: Started locksmithd.service - Cluster reboot manager. Jun 25 16:31:04.702435 systemd[1]: Reloading. Jun 25 16:31:04.843422 kernel: EXT4-fs (vda9): resized filesystem to 4635643 Jun 25 16:31:04.885139 locksmithd[1213]: locksmithd starting currentOperation="UPDATE_STATUS_IDLE" strategy="reboot" Jun 25 16:31:04.938628 extend-filesystems[1209]: Filesystem at /dev/vda9 is mounted on /; on-line resizing required Jun 25 16:31:04.938628 extend-filesystems[1209]: old_desc_blocks = 1, new_desc_blocks = 3 Jun 25 16:31:04.938628 extend-filesystems[1209]: The filesystem on /dev/vda9 is now 4635643 (4k) blocks long. Jun 25 16:31:04.947606 extend-filesystems[1177]: Resized filesystem in /dev/vda9 Jun 25 16:31:04.966712 systemd[1]: /usr/lib/systemd/system/docker.socket:6: ListenStream= references a path below legacy directory /var/run/, updating /var/run/docker.sock → /run/docker.sock; please update the unit file accordingly. Jun 25 16:31:05.051309 systemd[1]: extend-filesystems.service: Deactivated successfully. Jun 25 16:31:05.052152 systemd[1]: Finished extend-filesystems.service - Extend Filesystems. Jun 25 16:31:05.064239 systemd[1]: Started systemd-logind.service - User Login Management. Jun 25 16:31:05.077085 systemd[1]: Created slice system-sshd.slice - Slice /system/sshd. Jun 25 16:31:05.087817 systemd[1]: Starting oem-cloudinit.service - Run cloudinit... Jun 25 16:31:05.100762 bash[1288]: + OEMS=(aws gcp rackspace-onmetal azure cloudsigma packet vmware digitalocean openstack) Jun 25 16:31:05.101140 bash[1289]: + echo aws gcp rackspace-onmetal azure cloudsigma packet vmware digitalocean openstack Jun 25 16:31:05.101938 bash[1291]: + grep -q -x -F openstack Jun 25 16:31:05.102141 bash[1290]: + tr ' ' ' Jun 25 16:31:05.102141 bash[1290]: ' Jun 25 16:31:05.119000 bash[1293]: ++ '[' openstack = aws -o openstack = openstack ']' Jun 25 16:31:05.119000 bash[1293]: ++ echo ec2-compat Jun 25 16:31:05.119528 bash[1292]: + /usr/bin/coreos-cloudinit --oem=ec2-compat Jun 25 16:31:05.156474 containerd[1198]: time="2024-06-25T16:31:05.156373312Z" level=info msg="starting containerd" revision=99b8088b873ba42b788f29ccd0dc26ebb6952f1e version=v1.7.13 Jun 25 16:31:05.175925 bash[1292]: 2024/06/25 16:31:05 fetching token... Jun 25 16:31:05.192625 bash[1292]: 2024/06/25 16:31:05 error: token response status code 404 Jun 25 16:31:05.192625 bash[1292]: 2024/06/25 16:31:05 Checking availability of "cloud-drive" Jun 25 16:31:05.192763 bash[1292]: 2024/06/25 16:31:05 Checking availability of "ec2-metadata-service" Jun 25 16:31:05.202933 containerd[1198]: time="2024-06-25T16:31:05.202895421Z" level=info msg="loading plugin \"io.containerd.warning.v1.deprecations\"..." type=io.containerd.warning.v1 Jun 25 16:31:05.203054 containerd[1198]: time="2024-06-25T16:31:05.203036707Z" level=info msg="loading plugin \"io.containerd.snapshotter.v1.aufs\"..." type=io.containerd.snapshotter.v1 Jun 25 16:31:05.206757 sshd_keygen[1210]: ssh-keygen: generating new host keys: RSA ECDSA ED25519 Jun 25 16:31:05.207413 bash[1292]: 2024/06/25 16:31:05 Fetching meta-data from datasource of type "ec2-metadata-service" Jun 25 16:31:05.207413 bash[1292]: 2024/06/25 16:31:05 Fetching data from http://169.254.169.254/2009-04-04/meta-data/public-keys. Attempt #1 Jun 25 16:31:05.208534 containerd[1198]: time="2024-06-25T16:31:05.208505106Z" level=info msg="skip loading plugin \"io.containerd.snapshotter.v1.aufs\"..." error="aufs is not supported (modprobe aufs failed: exit status 1 \"modprobe: FATAL: Module aufs not found in directory /lib/modules/6.1.95-flatcar\\n\"): skip plugin" type=io.containerd.snapshotter.v1 Jun 25 16:31:05.208887 containerd[1198]: time="2024-06-25T16:31:05.208602051Z" level=info msg="loading plugin \"io.containerd.snapshotter.v1.btrfs\"..." type=io.containerd.snapshotter.v1 Jun 25 16:31:05.209192 containerd[1198]: time="2024-06-25T16:31:05.209169636Z" level=info msg="skip loading plugin \"io.containerd.snapshotter.v1.btrfs\"..." error="path /var/lib/containerd/io.containerd.snapshotter.v1.btrfs (ext4) must be a btrfs filesystem to be used with the btrfs snapshotter: skip plugin" type=io.containerd.snapshotter.v1 Jun 25 16:31:05.209275 containerd[1198]: time="2024-06-25T16:31:05.209258670Z" level=info msg="loading plugin \"io.containerd.content.v1.content\"..." type=io.containerd.content.v1 Jun 25 16:31:05.209463 containerd[1198]: time="2024-06-25T16:31:05.209443205Z" level=info msg="loading plugin \"io.containerd.snapshotter.v1.blockfile\"..." type=io.containerd.snapshotter.v1 Jun 25 16:31:05.209590 containerd[1198]: time="2024-06-25T16:31:05.209570022Z" level=info msg="skip loading plugin \"io.containerd.snapshotter.v1.blockfile\"..." error="no scratch file generator: skip plugin" type=io.containerd.snapshotter.v1 Jun 25 16:31:05.209672 containerd[1198]: time="2024-06-25T16:31:05.209654865Z" level=info msg="loading plugin \"io.containerd.snapshotter.v1.native\"..." type=io.containerd.snapshotter.v1 Jun 25 16:31:05.209851 containerd[1198]: time="2024-06-25T16:31:05.209832331Z" level=info msg="loading plugin \"io.containerd.snapshotter.v1.overlayfs\"..." type=io.containerd.snapshotter.v1 Jun 25 16:31:05.210171 containerd[1198]: time="2024-06-25T16:31:05.210152929Z" level=info msg="loading plugin \"io.containerd.snapshotter.v1.devmapper\"..." type=io.containerd.snapshotter.v1 Jun 25 16:31:05.210251 containerd[1198]: time="2024-06-25T16:31:05.210233449Z" level=warning msg="failed to load plugin io.containerd.snapshotter.v1.devmapper" error="devmapper not configured" Jun 25 16:31:05.210309 containerd[1198]: time="2024-06-25T16:31:05.210294989Z" level=info msg="loading plugin \"io.containerd.snapshotter.v1.zfs\"..." type=io.containerd.snapshotter.v1 Jun 25 16:31:05.210502 containerd[1198]: time="2024-06-25T16:31:05.210481289Z" level=info msg="skip loading plugin \"io.containerd.snapshotter.v1.zfs\"..." error="path /var/lib/containerd/io.containerd.snapshotter.v1.zfs must be a zfs filesystem to be used with the zfs snapshotter: skip plugin" type=io.containerd.snapshotter.v1 Jun 25 16:31:05.210568 containerd[1198]: time="2024-06-25T16:31:05.210554339Z" level=info msg="loading plugin \"io.containerd.metadata.v1.bolt\"..." type=io.containerd.metadata.v1 Jun 25 16:31:05.210672 containerd[1198]: time="2024-06-25T16:31:05.210654634Z" level=warning msg="could not use snapshotter devmapper in metadata plugin" error="devmapper not configured" Jun 25 16:31:05.210733 containerd[1198]: time="2024-06-25T16:31:05.210720294Z" level=info msg="metadata content store policy set" policy=shared Jun 25 16:31:05.218741 containerd[1198]: time="2024-06-25T16:31:05.218698877Z" level=info msg="loading plugin \"io.containerd.differ.v1.walking\"..." type=io.containerd.differ.v1 Jun 25 16:31:05.218849 containerd[1198]: time="2024-06-25T16:31:05.218746387Z" level=info msg="loading plugin \"io.containerd.event.v1.exchange\"..." type=io.containerd.event.v1 Jun 25 16:31:05.218849 containerd[1198]: time="2024-06-25T16:31:05.218765599Z" level=info msg="loading plugin \"io.containerd.gc.v1.scheduler\"..." type=io.containerd.gc.v1 Jun 25 16:31:05.218849 containerd[1198]: time="2024-06-25T16:31:05.218802952Z" level=info msg="loading plugin \"io.containerd.lease.v1.manager\"..." type=io.containerd.lease.v1 Jun 25 16:31:05.218849 containerd[1198]: time="2024-06-25T16:31:05.218820520Z" level=info msg="loading plugin \"io.containerd.nri.v1.nri\"..." type=io.containerd.nri.v1 Jun 25 16:31:05.218849 containerd[1198]: time="2024-06-25T16:31:05.218833396Z" level=info msg="NRI interface is disabled by configuration." Jun 25 16:31:05.218849 containerd[1198]: time="2024-06-25T16:31:05.218847464Z" level=info msg="loading plugin \"io.containerd.runtime.v2.task\"..." type=io.containerd.runtime.v2 Jun 25 16:31:05.219002 containerd[1198]: time="2024-06-25T16:31:05.218983316Z" level=info msg="loading plugin \"io.containerd.runtime.v2.shim\"..." type=io.containerd.runtime.v2 Jun 25 16:31:05.219035 containerd[1198]: time="2024-06-25T16:31:05.219005657Z" level=info msg="loading plugin \"io.containerd.sandbox.store.v1.local\"..." type=io.containerd.sandbox.store.v1 Jun 25 16:31:05.219035 containerd[1198]: time="2024-06-25T16:31:05.219022082Z" level=info msg="loading plugin \"io.containerd.sandbox.controller.v1.local\"..." type=io.containerd.sandbox.controller.v1 Jun 25 16:31:05.219102 containerd[1198]: time="2024-06-25T16:31:05.219038598Z" level=info msg="loading plugin \"io.containerd.streaming.v1.manager\"..." type=io.containerd.streaming.v1 Jun 25 16:31:05.219102 containerd[1198]: time="2024-06-25T16:31:05.219056196Z" level=info msg="loading plugin \"io.containerd.service.v1.introspection-service\"..." type=io.containerd.service.v1 Jun 25 16:31:05.219102 containerd[1198]: time="2024-06-25T16:31:05.219076271Z" level=info msg="loading plugin \"io.containerd.service.v1.containers-service\"..." type=io.containerd.service.v1 Jun 25 16:31:05.219102 containerd[1198]: time="2024-06-25T16:31:05.219091462Z" level=info msg="loading plugin \"io.containerd.service.v1.content-service\"..." type=io.containerd.service.v1 Jun 25 16:31:05.219200 containerd[1198]: time="2024-06-25T16:31:05.219107316Z" level=info msg="loading plugin \"io.containerd.service.v1.diff-service\"..." type=io.containerd.service.v1 Jun 25 16:31:05.219200 containerd[1198]: time="2024-06-25T16:31:05.219141410Z" level=info msg="loading plugin \"io.containerd.service.v1.images-service\"..." type=io.containerd.service.v1 Jun 25 16:31:05.219200 containerd[1198]: time="2024-06-25T16:31:05.219157564Z" level=info msg="loading plugin \"io.containerd.service.v1.namespaces-service\"..." type=io.containerd.service.v1 Jun 25 16:31:05.219200 containerd[1198]: time="2024-06-25T16:31:05.219172916Z" level=info msg="loading plugin \"io.containerd.service.v1.snapshots-service\"..." type=io.containerd.service.v1 Jun 25 16:31:05.219200 containerd[1198]: time="2024-06-25T16:31:05.219186694Z" level=info msg="loading plugin \"io.containerd.runtime.v1.linux\"..." type=io.containerd.runtime.v1 Jun 25 16:31:05.219319 containerd[1198]: time="2024-06-25T16:31:05.219293105Z" level=info msg="loading plugin \"io.containerd.monitor.v1.cgroups\"..." type=io.containerd.monitor.v1 Jun 25 16:31:05.219618 containerd[1198]: time="2024-06-25T16:31:05.219594811Z" level=info msg="loading plugin \"io.containerd.service.v1.tasks-service\"..." type=io.containerd.service.v1 Jun 25 16:31:05.219663 containerd[1198]: time="2024-06-25T16:31:05.219629346Z" level=info msg="loading plugin \"io.containerd.grpc.v1.introspection\"..." type=io.containerd.grpc.v1 Jun 25 16:31:05.219663 containerd[1198]: time="2024-06-25T16:31:05.219645991Z" level=info msg="loading plugin \"io.containerd.transfer.v1.local\"..." type=io.containerd.transfer.v1 Jun 25 16:31:05.219739 containerd[1198]: time="2024-06-25T16:31:05.219674810Z" level=info msg="loading plugin \"io.containerd.internal.v1.restart\"..." type=io.containerd.internal.v1 Jun 25 16:31:05.219739 containerd[1198]: time="2024-06-25T16:31:05.219730703Z" level=info msg="loading plugin \"io.containerd.grpc.v1.containers\"..." type=io.containerd.grpc.v1 Jun 25 16:31:05.219801 containerd[1198]: time="2024-06-25T16:31:05.219747059Z" level=info msg="loading plugin \"io.containerd.grpc.v1.content\"..." type=io.containerd.grpc.v1 Jun 25 16:31:05.219801 containerd[1198]: time="2024-06-25T16:31:05.219763694Z" level=info msg="loading plugin \"io.containerd.grpc.v1.diff\"..." type=io.containerd.grpc.v1 Jun 25 16:31:05.219801 containerd[1198]: time="2024-06-25T16:31:05.219777722Z" level=info msg="loading plugin \"io.containerd.grpc.v1.events\"..." type=io.containerd.grpc.v1 Jun 25 16:31:05.219801 containerd[1198]: time="2024-06-25T16:31:05.219792021Z" level=info msg="loading plugin \"io.containerd.grpc.v1.healthcheck\"..." type=io.containerd.grpc.v1 Jun 25 16:31:05.219901 containerd[1198]: time="2024-06-25T16:31:05.219806050Z" level=info msg="loading plugin \"io.containerd.grpc.v1.images\"..." type=io.containerd.grpc.v1 Jun 25 16:31:05.219901 containerd[1198]: time="2024-06-25T16:31:05.219820359Z" level=info msg="loading plugin \"io.containerd.grpc.v1.leases\"..." type=io.containerd.grpc.v1 Jun 25 16:31:05.219901 containerd[1198]: time="2024-06-25T16:31:05.219833756Z" level=info msg="loading plugin \"io.containerd.grpc.v1.namespaces\"..." type=io.containerd.grpc.v1 Jun 25 16:31:05.219901 containerd[1198]: time="2024-06-25T16:31:05.219849930Z" level=info msg="loading plugin \"io.containerd.internal.v1.opt\"..." type=io.containerd.internal.v1 Jun 25 16:31:05.220037 containerd[1198]: time="2024-06-25T16:31:05.220012375Z" level=info msg="loading plugin \"io.containerd.grpc.v1.sandbox-controllers\"..." type=io.containerd.grpc.v1 Jun 25 16:31:05.220093 containerd[1198]: time="2024-06-25T16:31:05.220039580Z" level=info msg="loading plugin \"io.containerd.grpc.v1.sandboxes\"..." type=io.containerd.grpc.v1 Jun 25 16:31:05.220093 containerd[1198]: time="2024-06-25T16:31:05.220055192Z" level=info msg="loading plugin \"io.containerd.grpc.v1.snapshots\"..." type=io.containerd.grpc.v1 Jun 25 16:31:05.220093 containerd[1198]: time="2024-06-25T16:31:05.220069381Z" level=info msg="loading plugin \"io.containerd.grpc.v1.streaming\"..." type=io.containerd.grpc.v1 Jun 25 16:31:05.220093 containerd[1198]: time="2024-06-25T16:31:05.220083008Z" level=info msg="loading plugin \"io.containerd.grpc.v1.tasks\"..." type=io.containerd.grpc.v1 Jun 25 16:31:05.220194 containerd[1198]: time="2024-06-25T16:31:05.220099433Z" level=info msg="loading plugin \"io.containerd.grpc.v1.transfer\"..." type=io.containerd.grpc.v1 Jun 25 16:31:05.220194 containerd[1198]: time="2024-06-25T16:31:05.220115367Z" level=info msg="loading plugin \"io.containerd.grpc.v1.version\"..." type=io.containerd.grpc.v1 Jun 25 16:31:05.220194 containerd[1198]: time="2024-06-25T16:31:05.220128924Z" level=info msg="loading plugin \"io.containerd.grpc.v1.cri\"..." type=io.containerd.grpc.v1 Jun 25 16:31:05.220496 containerd[1198]: time="2024-06-25T16:31:05.220422609Z" level=info msg="Start cri plugin with config {PluginConfig:{ContainerdConfig:{Snapshotter:overlayfs DefaultRuntimeName:runc DefaultRuntime:{Type: Path: Engine: PodAnnotations:[] ContainerAnnotations:[] Root: Options:map[] PrivilegedWithoutHostDevices:false PrivilegedWithoutHostDevicesAllDevicesAllowed:false BaseRuntimeSpec: NetworkPluginConfDir: NetworkPluginMaxConfNum:0 Snapshotter: SandboxMode:} UntrustedWorkloadRuntime:{Type: Path: Engine: PodAnnotations:[] ContainerAnnotations:[] Root: Options:map[] PrivilegedWithoutHostDevices:false PrivilegedWithoutHostDevicesAllDevicesAllowed:false BaseRuntimeSpec: NetworkPluginConfDir: NetworkPluginMaxConfNum:0 Snapshotter: SandboxMode:} Runtimes:map[runc:{Type:io.containerd.runc.v2 Path: Engine: PodAnnotations:[] ContainerAnnotations:[] Root: Options:map[SystemdCgroup:true] PrivilegedWithoutHostDevices:false PrivilegedWithoutHostDevicesAllDevicesAllowed:false BaseRuntimeSpec: NetworkPluginConfDir: NetworkPluginMaxConfNum:0 Snapshotter: SandboxMode:podsandbox}] NoPivot:false DisableSnapshotAnnotations:true DiscardUnpackedLayers:false IgnoreBlockIONotEnabledErrors:false IgnoreRdtNotEnabledErrors:false} CniConfig:{NetworkPluginBinDir:/opt/cni/bin NetworkPluginConfDir:/etc/cni/net.d NetworkPluginMaxConfNum:1 NetworkPluginSetupSerially:false NetworkPluginConfTemplate: IPPreference:} Registry:{ConfigPath: Mirrors:map[] Configs:map[] Auths:map[] Headers:map[]} ImageDecryption:{KeyModel:node} DisableTCPService:true StreamServerAddress:127.0.0.1 StreamServerPort:0 StreamIdleTimeout:4h0m0s EnableSelinux:true SelinuxCategoryRange:1024 SandboxImage:registry.k8s.io/pause:3.8 StatsCollectPeriod:10 SystemdCgroup:false EnableTLSStreaming:false X509KeyPairStreaming:{TLSCertFile: TLSKeyFile:} MaxContainerLogLineSize:16384 DisableCgroup:false DisableApparmor:false RestrictOOMScoreAdj:false MaxConcurrentDownloads:3 DisableProcMount:false UnsetSeccompProfile: TolerateMissingHugetlbController:true DisableHugetlbController:true DeviceOwnershipFromSecurityContext:false IgnoreImageDefinedVolumes:false NetNSMountsUnderStateDir:false EnableUnprivilegedPorts:false EnableUnprivilegedICMP:false EnableCDI:false CDISpecDirs:[/etc/cdi /var/run/cdi] ImagePullProgressTimeout:5m0s DrainExecSyncIOTimeout:0s} 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}" Jun 25 16:31:05.220660 containerd[1198]: time="2024-06-25T16:31:05.220497002Z" level=info msg="Connect containerd service" Jun 25 16:31:05.220660 containerd[1198]: time="2024-06-25T16:31:05.220523916Z" level=info msg="using legacy CRI server" Jun 25 16:31:05.220660 containerd[1198]: time="2024-06-25T16:31:05.220530976Z" level=info msg="using experimental NRI integration - disable nri plugin to prevent this" Jun 25 16:31:05.220660 containerd[1198]: time="2024-06-25T16:31:05.220575056Z" level=info msg="Get image filesystem path \"/var/lib/containerd/io.containerd.snapshotter.v1.overlayfs\"" Jun 25 16:31:05.221185 containerd[1198]: time="2024-06-25T16:31:05.221140024Z" level=error msg="failed to load cni during init, please check CRI plugin status before setting up network for pods" error="cni config load failed: no network config found in /etc/cni/net.d: cni plugin not initialized: failed to load cni config" Jun 25 16:31:05.221234 containerd[1198]: time="2024-06-25T16:31:05.221199446Z" level=info msg="loading plugin \"io.containerd.tracing.processor.v1.otlp\"..." type=io.containerd.tracing.processor.v1 Jun 25 16:31:05.221234 containerd[1198]: time="2024-06-25T16:31:05.221218529Z" level=info msg="skip loading plugin \"io.containerd.tracing.processor.v1.otlp\"..." error="no OpenTelemetry endpoint: skip plugin" type=io.containerd.tracing.processor.v1 Jun 25 16:31:05.221285 containerd[1198]: time="2024-06-25T16:31:05.221230772Z" level=info msg="loading plugin \"io.containerd.internal.v1.tracing\"..." type=io.containerd.internal.v1 Jun 25 16:31:05.221285 containerd[1198]: time="2024-06-25T16:31:05.221244339Z" level=info msg="skipping tracing processor initialization (no tracing plugin)" error="no OpenTelemetry endpoint: skip plugin" Jun 25 16:31:05.222306 containerd[1198]: time="2024-06-25T16:31:05.221615185Z" level=info msg="Start subscribing containerd event" Jun 25 16:31:05.222306 containerd[1198]: time="2024-06-25T16:31:05.221692547Z" level=info msg="Start recovering state" Jun 25 16:31:05.222306 containerd[1198]: time="2024-06-25T16:31:05.221768976Z" level=info msg="Start event monitor" Jun 25 16:31:05.222306 containerd[1198]: time="2024-06-25T16:31:05.221796160Z" level=info msg="Start snapshots syncer" Jun 25 16:31:05.222306 containerd[1198]: time="2024-06-25T16:31:05.221818733Z" level=info msg="Start cni network conf syncer for default" Jun 25 16:31:05.222306 containerd[1198]: time="2024-06-25T16:31:05.221902071Z" level=info msg="Start streaming server" Jun 25 16:31:05.222306 containerd[1198]: time="2024-06-25T16:31:05.222064395Z" level=info msg=serving... address=/run/containerd/containerd.sock.ttrpc Jun 25 16:31:05.222306 containerd[1198]: time="2024-06-25T16:31:05.222118915Z" level=info msg=serving... address=/run/containerd/containerd.sock Jun 25 16:31:05.222562 bash[1292]: 2024/06/25 16:31:05 Fetching data from http://169.254.169.254/2009-04-04/meta-data/public-keys/0/openssh-key. Attempt #1 Jun 25 16:31:05.222807 systemd[1]: Started containerd.service - containerd container runtime. Jun 25 16:31:05.224718 containerd[1198]: time="2024-06-25T16:31:05.224685324Z" level=info msg="containerd successfully booted in 0.069583s" Jun 25 16:31:05.236855 bash[1292]: 2024/06/25 16:31:05 Found SSH key for "ci-3815-2-4-e0450dc8-407b-4e7e-b2bf-5b2a31d49a0d" Jun 25 16:31:05.236855 bash[1292]: 2024/06/25 16:31:05 Fetching data from http://169.254.169.254/2009-04-04/meta-data/hostname. Attempt #1 Jun 25 16:31:05.238277 systemd[1]: Finished sshd-keygen.service - Generate sshd host keys. Jun 25 16:31:05.243069 systemd[1]: Starting issuegen.service - Generate /run/issue... Jun 25 16:31:05.247204 systemd[1]: Started sshd@0-172.24.4.212:22-172.24.4.1:47098.service - OpenSSH per-connection server daemon. Jun 25 16:31:05.251278 systemd[1]: issuegen.service: Deactivated successfully. Jun 25 16:31:05.251479 systemd[1]: Finished issuegen.service - Generate /run/issue. Jun 25 16:31:05.251927 bash[1292]: 2024/06/25 16:31:05 Fetching data from http://169.254.169.254/2009-04-04/meta-data/local-ipv4. Attempt #1 Jun 25 16:31:05.264086 systemd[1]: Starting systemd-user-sessions.service - Permit User Sessions... Jun 25 16:31:05.275446 bash[1292]: 2024/06/25 16:31:05 Fetching data from http://169.254.169.254/2009-04-04/meta-data/public-ipv4. Attempt #1 Jun 25 16:31:05.275694 systemd[1]: Finished systemd-user-sessions.service - Permit User Sessions. Jun 25 16:31:05.281977 systemd[1]: Started getty@tty1.service - Getty on tty1. Jun 25 16:31:05.289852 bash[1292]: 2024/06/25 16:31:05 Fetching user-data from datasource of type "ec2-metadata-service" Jun 25 16:31:05.289852 bash[1292]: 2024/06/25 16:31:05 Fetching data from http://169.254.169.254/2009-04-04/user-data. Attempt #1 Jun 25 16:31:05.291925 systemd[1]: Started serial-getty@ttyS0.service - Serial Getty on ttyS0. Jun 25 16:31:05.299764 systemd[1]: Reached target getty.target - Login Prompts. Jun 25 16:31:05.310008 dbus-daemon[1173]: [system] Activating via systemd: service name='org.freedesktop.hostname1' unit='dbus-org.freedesktop.hostname1.service' requested by ':1.8' (uid=0 pid=1315 comm="hostnamectl set-hostname ci-3815-2-4-1-fc28402a5e" label="system_u:system_r:kernel_t:s0") Jun 25 16:31:05.321168 systemd[1]: Starting systemd-hostnamed.service - Hostname Service... Jun 25 16:31:05.372214 dbus-daemon[1173]: [system] Successfully activated service 'org.freedesktop.hostname1' Jun 25 16:31:05.372372 systemd[1]: Started systemd-hostnamed.service - Hostname Service. Jun 25 16:31:05.373588 systemd-resolved[1144]: System hostname changed to 'ci-3815-2-4-1-fc28402a5e'. Jun 25 16:31:05.373791 systemd-hostnamed[1316]: Hostname set to (static) Jun 25 16:31:05.375264 bash[1292]: 2024/06/25 16:31:05 Set hostname to ci-3815-2-4-1-fc28402a5e Jun 25 16:31:05.398627 bash[1292]: 2024/06/25 16:31:05 Authorized SSH keys for core user Jun 25 16:31:05.400026 systemd[1]: oem-cloudinit.service: Deactivated successfully. Jun 25 16:31:05.400622 systemd[1]: Finished oem-cloudinit.service - Run cloudinit. Jun 25 16:31:05.407953 systemd[1]: Finished enable-oem-cloudinit.service - Enable cloudinit. Jun 25 16:31:06.194081 sshd[1308]: Accepted publickey for core from 172.24.4.1 port 47098 ssh2: RSA SHA256:28OIdiFmM2tDKGFH/eV86Nr5Hdswek2nBOxwiGuzcsE Jun 25 16:31:06.198690 sshd[1308]: pam_unix(sshd:session): session opened for user core(uid=500) by (uid=0) Jun 25 16:31:06.222881 systemd-logind[1188]: New session 1 of user core. Jun 25 16:31:06.227193 systemd[1]: Created slice user-500.slice - User Slice of UID 500. Jun 25 16:31:06.245487 systemd[1]: Starting user-runtime-dir@500.service - User Runtime Directory /run/user/500... Jun 25 16:31:06.273901 systemd[1]: Finished user-runtime-dir@500.service - User Runtime Directory /run/user/500. Jun 25 16:31:06.290241 systemd[1]: Starting user@500.service - User Manager for UID 500... Jun 25 16:31:06.299502 (systemd)[1321]: pam_unix(systemd-user:session): session opened for user core(uid=500) by (uid=0) Jun 25 16:31:06.437788 systemd[1321]: Queued start job for default target default.target. Jun 25 16:31:06.446137 systemd[1321]: Reached target paths.target - Paths. Jun 25 16:31:06.446163 systemd[1321]: Reached target sockets.target - Sockets. Jun 25 16:31:06.446178 systemd[1321]: Reached target timers.target - Timers. Jun 25 16:31:06.446205 systemd[1321]: Reached target basic.target - Basic System. Jun 25 16:31:06.446252 systemd[1321]: Reached target default.target - Main User Target. Jun 25 16:31:06.446282 systemd[1321]: Startup finished in 132ms. Jun 25 16:31:06.446380 systemd[1]: Started user@500.service - User Manager for UID 500. Jun 25 16:31:06.448477 systemd[1]: Started session-1.scope - Session 1 of User core. Jun 25 16:31:06.856982 systemd[1]: Started sshd@1-172.24.4.212:22-172.24.4.1:47106.service - OpenSSH per-connection server daemon (172.24.4.1:47106). Jun 25 16:31:08.254878 sshd[1330]: Accepted publickey for core from 172.24.4.1 port 47106 ssh2: RSA SHA256:28OIdiFmM2tDKGFH/eV86Nr5Hdswek2nBOxwiGuzcsE Jun 25 16:31:08.257787 sshd[1330]: pam_unix(sshd:session): session opened for user core(uid=500) by (uid=0) Jun 25 16:31:08.267559 systemd-logind[1188]: New session 2 of user core. Jun 25 16:31:08.275803 systemd[1]: Started session-2.scope - Session 2 of User core. Jun 25 16:31:08.897284 sshd[1330]: pam_unix(sshd:session): session closed for user core Jun 25 16:31:08.905968 systemd[1]: sshd@1-172.24.4.212:22-172.24.4.1:47106.service: Deactivated successfully. Jun 25 16:31:08.907872 systemd[1]: session-2.scope: Deactivated successfully. Jun 25 16:31:08.909458 systemd-logind[1188]: Session 2 logged out. Waiting for processes to exit. Jun 25 16:31:08.918964 systemd[1]: Started sshd@2-172.24.4.212:22-172.24.4.1:47108.service - OpenSSH per-connection server daemon (172.24.4.1:47108). Jun 25 16:31:08.932946 systemd-logind[1188]: Removed session 2. Jun 25 16:31:10.189127 sshd[1338]: Accepted publickey for core from 172.24.4.1 port 47108 ssh2: RSA SHA256:28OIdiFmM2tDKGFH/eV86Nr5Hdswek2nBOxwiGuzcsE Jun 25 16:31:10.192863 sshd[1338]: pam_unix(sshd:session): session opened for user core(uid=500) by (uid=0) Jun 25 16:31:10.205764 systemd-logind[1188]: New session 3 of user core. Jun 25 16:31:10.217022 systemd[1]: Started session-3.scope - Session 3 of User core. Jun 25 16:31:10.749703 sshd[1338]: pam_unix(sshd:session): session closed for user core Jun 25 16:31:10.756133 systemd-logind[1188]: Session 3 logged out. Waiting for processes to exit. Jun 25 16:31:10.757174 systemd[1]: sshd@2-172.24.4.212:22-172.24.4.1:47108.service: Deactivated successfully. Jun 25 16:31:10.759547 systemd[1]: session-3.scope: Deactivated successfully. Jun 25 16:31:10.762357 systemd-logind[1188]: Removed session 3. Jun 25 16:31:11.530897 coreos-metadata[1172]: Jun 25 16:31:11.530 WARN failed to locate config-drive, using the metadata service API instead Jun 25 16:31:11.624060 coreos-metadata[1172]: Jun 25 16:31:11.623 INFO Fetching http://169.254.169.254/openstack/2012-08-10/meta_data.json: Attempt #1 Jun 25 16:31:11.642191 coreos-metadata[1172]: Jun 25 16:31:11.642 INFO Fetch successful Jun 25 16:31:11.642191 coreos-metadata[1172]: Jun 25 16:31:11.642 INFO Fetching http://169.254.169.254/latest/meta-data/hostname: Attempt #1 Jun 25 16:31:11.660151 coreos-metadata[1172]: Jun 25 16:31:11.660 INFO Fetch successful Jun 25 16:31:11.660211 coreos-metadata[1172]: Jun 25 16:31:11.660 INFO Fetching http://169.254.169.254/latest/meta-data/instance-id: Attempt #1 Jun 25 16:31:11.675353 coreos-metadata[1172]: Jun 25 16:31:11.675 INFO Fetch successful Jun 25 16:31:11.675562 coreos-metadata[1172]: Jun 25 16:31:11.675 INFO Fetching http://169.254.169.254/latest/meta-data/instance-type: Attempt #1 Jun 25 16:31:11.690856 coreos-metadata[1172]: Jun 25 16:31:11.690 INFO Fetch successful Jun 25 16:31:11.690856 coreos-metadata[1172]: Jun 25 16:31:11.690 INFO Fetching http://169.254.169.254/latest/meta-data/local-ipv4: Attempt #1 Jun 25 16:31:11.707040 coreos-metadata[1172]: Jun 25 16:31:11.706 INFO Fetch successful Jun 25 16:31:11.707040 coreos-metadata[1172]: Jun 25 16:31:11.707 INFO Fetching http://169.254.169.254/latest/meta-data/public-ipv4: Attempt #1 Jun 25 16:31:11.722682 coreos-metadata[1172]: Jun 25 16:31:11.722 INFO Fetch successful Jun 25 16:31:11.747249 systemd[1]: Finished coreos-metadata.service - Flatcar Metadata Agent. Jun 25 16:31:11.748350 systemd[1]: packet-phone-home.service - Report Success to Packet was skipped because no trigger condition checks were met. Jun 25 16:31:11.860085 coreos-metadata[1212]: Jun 25 16:31:11.858 WARN failed to locate config-drive, using the metadata service API instead Jun 25 16:31:11.951754 coreos-metadata[1212]: Jun 25 16:31:11.951 INFO Fetching http://169.254.169.254/latest/meta-data/public-keys: Attempt #1 Jun 25 16:31:11.969939 coreos-metadata[1212]: Jun 25 16:31:11.969 INFO Fetch successful Jun 25 16:31:11.970170 coreos-metadata[1212]: Jun 25 16:31:11.970 INFO Fetching http://169.254.169.254/latest/meta-data/public-keys/0/openssh-key: Attempt #1 Jun 25 16:31:11.984993 coreos-metadata[1212]: Jun 25 16:31:11.984 INFO Fetch successful Jun 25 16:31:11.989610 unknown[1212]: wrote ssh authorized keys file for user: core Jun 25 16:31:12.017169 update-ssh-keys[1349]: Updated "/home/core/.ssh/authorized_keys" Jun 25 16:31:12.017879 systemd[1]: Finished coreos-metadata-sshkeys@core.service - Flatcar Metadata Agent (SSH Keys). Jun 25 16:31:12.020954 systemd[1]: Finished sshkeys.service. Jun 25 16:31:12.021633 systemd[1]: Reached target multi-user.target - Multi-User System. Jun 25 16:31:12.030074 systemd[1]: Starting systemd-update-utmp-runlevel.service - Record Runlevel Change in UTMP... Jun 25 16:31:12.040082 systemd[1]: systemd-update-utmp-runlevel.service: Deactivated successfully. Jun 25 16:31:12.040523 systemd[1]: Finished systemd-update-utmp-runlevel.service - Record Runlevel Change in UTMP. Jun 25 16:31:12.041575 systemd[1]: Startup finished in 1.121s (kernel) + 4.307s (initrd) + 10.989s (userspace) = 16.418s. Jun 25 16:31:20.777816 systemd[1]: Started sshd@3-172.24.4.212:22-172.24.4.1:58058.service - OpenSSH per-connection server daemon (172.24.4.1:58058). Jun 25 16:31:22.264139 sshd[1352]: Accepted publickey for core from 172.24.4.1 port 58058 ssh2: RSA SHA256:28OIdiFmM2tDKGFH/eV86Nr5Hdswek2nBOxwiGuzcsE Jun 25 16:31:22.267351 sshd[1352]: pam_unix(sshd:session): session opened for user core(uid=500) by (uid=0) Jun 25 16:31:22.277993 systemd-logind[1188]: New session 4 of user core. Jun 25 16:31:22.284815 systemd[1]: Started session-4.scope - Session 4 of User core. Jun 25 16:31:22.899169 sshd[1352]: pam_unix(sshd:session): session closed for user core Jun 25 16:31:22.910637 systemd[1]: sshd@3-172.24.4.212:22-172.24.4.1:58058.service: Deactivated successfully. Jun 25 16:31:22.912101 systemd[1]: session-4.scope: Deactivated successfully. Jun 25 16:31:22.914608 systemd-logind[1188]: Session 4 logged out. Waiting for processes to exit. Jun 25 16:31:22.924140 systemd[1]: Started sshd@4-172.24.4.212:22-172.24.4.1:58068.service - OpenSSH per-connection server daemon (172.24.4.1:58068). Jun 25 16:31:22.927680 systemd-logind[1188]: Removed session 4. Jun 25 16:31:24.111801 sshd[1358]: Accepted publickey for core from 172.24.4.1 port 58068 ssh2: RSA SHA256:28OIdiFmM2tDKGFH/eV86Nr5Hdswek2nBOxwiGuzcsE Jun 25 16:31:24.115915 sshd[1358]: pam_unix(sshd:session): session opened for user core(uid=500) by (uid=0) Jun 25 16:31:24.128553 systemd-logind[1188]: New session 5 of user core. Jun 25 16:31:24.135918 systemd[1]: Started session-5.scope - Session 5 of User core. Jun 25 16:31:24.696711 sshd[1358]: pam_unix(sshd:session): session closed for user core Jun 25 16:31:24.704788 systemd[1]: sshd@4-172.24.4.212:22-172.24.4.1:58068.service: Deactivated successfully. Jun 25 16:31:24.705720 systemd[1]: session-5.scope: Deactivated successfully. Jun 25 16:31:24.707185 systemd-logind[1188]: Session 5 logged out. Waiting for processes to exit. Jun 25 16:31:24.726401 systemd[1]: Started sshd@5-172.24.4.212:22-172.24.4.1:55876.service - OpenSSH per-connection server daemon (172.24.4.1:55876). Jun 25 16:31:24.728515 systemd-logind[1188]: Removed session 5. Jun 25 16:31:25.971515 sshd[1364]: Accepted publickey for core from 172.24.4.1 port 55876 ssh2: RSA SHA256:28OIdiFmM2tDKGFH/eV86Nr5Hdswek2nBOxwiGuzcsE Jun 25 16:31:25.974857 sshd[1364]: pam_unix(sshd:session): session opened for user core(uid=500) by (uid=0) Jun 25 16:31:25.983503 systemd-logind[1188]: New session 6 of user core. Jun 25 16:31:25.990730 systemd[1]: Started session-6.scope - Session 6 of User core. Jun 25 16:31:26.736242 sshd[1364]: pam_unix(sshd:session): session closed for user core Jun 25 16:31:26.743109 systemd[1]: sshd@5-172.24.4.212:22-172.24.4.1:55876.service: Deactivated successfully. Jun 25 16:31:26.744193 systemd[1]: session-6.scope: Deactivated successfully. Jun 25 16:31:26.745090 systemd-logind[1188]: Session 6 logged out. Waiting for processes to exit. Jun 25 16:31:26.754149 systemd[1]: Started sshd@6-172.24.4.212:22-172.24.4.1:55884.service - OpenSSH per-connection server daemon (172.24.4.1:55884). Jun 25 16:31:26.756192 systemd-logind[1188]: Removed session 6. Jun 25 16:31:28.033019 sshd[1371]: Accepted publickey for core from 172.24.4.1 port 55884 ssh2: RSA SHA256:28OIdiFmM2tDKGFH/eV86Nr5Hdswek2nBOxwiGuzcsE Jun 25 16:31:28.035716 sshd[1371]: pam_unix(sshd:session): session opened for user core(uid=500) by (uid=0) Jun 25 16:31:28.044451 systemd-logind[1188]: New session 7 of user core. Jun 25 16:31:28.058721 systemd[1]: Started session-7.scope - Session 7 of User core. Jun 25 16:31:28.471627 sudo[1374]: core : PWD=/home/core ; USER=root ; COMMAND=/usr/sbin/setenforce 1 Jun 25 16:31:28.472485 sudo[1374]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=500) Jun 25 16:31:28.488557 sudo[1374]: pam_unix(sudo:session): session closed for user root Jun 25 16:31:28.679705 sshd[1371]: pam_unix(sshd:session): session closed for user core Jun 25 16:31:28.688145 systemd[1]: sshd@6-172.24.4.212:22-172.24.4.1:55884.service: Deactivated successfully. Jun 25 16:31:28.689544 systemd[1]: session-7.scope: Deactivated successfully. Jun 25 16:31:28.690548 systemd-logind[1188]: Session 7 logged out. Waiting for processes to exit. Jun 25 16:31:28.697553 systemd[1]: Started sshd@7-172.24.4.212:22-172.24.4.1:55888.service - OpenSSH per-connection server daemon (172.24.4.1:55888). Jun 25 16:31:28.701070 systemd-logind[1188]: Removed session 7. Jun 25 16:31:30.100731 sshd[1378]: Accepted publickey for core from 172.24.4.1 port 55888 ssh2: RSA SHA256:28OIdiFmM2tDKGFH/eV86Nr5Hdswek2nBOxwiGuzcsE Jun 25 16:31:30.103176 sshd[1378]: pam_unix(sshd:session): session opened for user core(uid=500) by (uid=0) Jun 25 16:31:30.112531 systemd-logind[1188]: New session 8 of user core. Jun 25 16:31:30.116707 systemd[1]: Started session-8.scope - Session 8 of User core. Jun 25 16:31:30.529281 sudo[1382]: core : PWD=/home/core ; USER=root ; COMMAND=/usr/bin/rm -rf /etc/audit/rules.d/80-selinux.rules /etc/audit/rules.d/99-default.rules Jun 25 16:31:30.530606 sudo[1382]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=500) Jun 25 16:31:30.537853 sudo[1382]: pam_unix(sudo:session): session closed for user root Jun 25 16:31:30.548864 sudo[1381]: core : PWD=/home/core ; USER=root ; COMMAND=/usr/bin/systemctl restart audit-rules Jun 25 16:31:30.549496 sudo[1381]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=500) Jun 25 16:31:30.574113 systemd[1]: Stopping audit-rules.service - Load Security Auditing Rules... Jun 25 16:31:30.576000 audit: CONFIG_CHANGE auid=4294967295 ses=4294967295 subj=system_u:system_r:kernel_t:s0 op=remove_rule key=(null) list=5 res=1 Jun 25 16:31:30.577745 auditctl[1385]: No rules Jun 25 16:31:30.578115 kernel: kauditd_printk_skb: 120 callbacks suppressed Jun 25 16:31:30.578187 kernel: audit: type=1305 audit(1719333090.576:187): auid=4294967295 ses=4294967295 subj=system_u:system_r:kernel_t:s0 op=remove_rule key=(null) list=5 res=1 Jun 25 16:31:30.578831 systemd[1]: audit-rules.service: Deactivated successfully. Jun 25 16:31:30.579203 systemd[1]: Stopped audit-rules.service - Load Security Auditing Rules. Jun 25 16:31:30.576000 audit[1385]: SYSCALL arch=c000003e syscall=44 success=yes exit=1056 a0=3 a1=7fff16a2a480 a2=420 a3=0 items=0 ppid=1 pid=1385 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/sbin/auditctl" subj=system_u:system_r:kernel_t:s0 key=(null) Jun 25 16:31:30.591079 kernel: audit: type=1300 audit(1719333090.576:187): arch=c000003e syscall=44 success=yes exit=1056 a0=3 a1=7fff16a2a480 a2=420 a3=0 items=0 ppid=1 pid=1385 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/sbin/auditctl" subj=system_u:system_r:kernel_t:s0 key=(null) Jun 25 16:31:30.591260 kernel: audit: type=1327 audit(1719333090.576:187): proctitle=2F7362696E2F617564697463746C002D44 Jun 25 16:31:30.591309 kernel: audit: type=1131 audit(1719333090.577:188): pid=1 uid=0 auid=4294967295 ses=4294967295 subj=system_u:system_r:kernel_t:s0 msg='unit=audit-rules comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Jun 25 16:31:30.576000 audit: PROCTITLE proctitle=2F7362696E2F617564697463746C002D44 Jun 25 16:31:30.577000 audit[1]: SERVICE_STOP pid=1 uid=0 auid=4294967295 ses=4294967295 subj=system_u:system_r:kernel_t:s0 msg='unit=audit-rules comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Jun 25 16:31:30.590901 systemd[1]: Starting audit-rules.service - Load Security Auditing Rules... Jun 25 16:31:30.636692 augenrules[1402]: No rules Jun 25 16:31:30.637966 systemd[1]: Finished audit-rules.service - Load Security Auditing Rules. Jun 25 16:31:30.644569 kernel: audit: type=1130 audit(1719333090.638:189): pid=1 uid=0 auid=4294967295 ses=4294967295 subj=system_u:system_r:kernel_t:s0 msg='unit=audit-rules comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Jun 25 16:31:30.638000 audit[1]: SERVICE_START pid=1 uid=0 auid=4294967295 ses=4294967295 subj=system_u:system_r:kernel_t:s0 msg='unit=audit-rules comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Jun 25 16:31:30.639762 sudo[1381]: pam_unix(sudo:session): session closed for user root Jun 25 16:31:30.639000 audit[1381]: USER_END pid=1381 uid=500 auid=500 ses=8 subj=system_u:system_r:kernel_t:s0 msg='op=PAM:session_close grantors=pam_limits,pam_env,pam_unix,pam_permit,pam_systemd acct="root" exe="/usr/bin/sudo" hostname=? addr=? terminal=? res=success' Jun 25 16:31:30.639000 audit[1381]: CRED_DISP pid=1381 uid=500 auid=500 ses=8 subj=system_u:system_r:kernel_t:s0 msg='op=PAM:setcred grantors=pam_env,pam_faillock,pam_unix acct="root" exe="/usr/bin/sudo" hostname=? addr=? terminal=? res=success' Jun 25 16:31:30.654226 kernel: audit: type=1106 audit(1719333090.639:190): pid=1381 uid=500 auid=500 ses=8 subj=system_u:system_r:kernel_t:s0 msg='op=PAM:session_close grantors=pam_limits,pam_env,pam_unix,pam_permit,pam_systemd acct="root" exe="/usr/bin/sudo" hostname=? addr=? terminal=? res=success' Jun 25 16:31:30.654305 kernel: audit: type=1104 audit(1719333090.639:191): pid=1381 uid=500 auid=500 ses=8 subj=system_u:system_r:kernel_t:s0 msg='op=PAM:setcred grantors=pam_env,pam_faillock,pam_unix acct="root" exe="/usr/bin/sudo" hostname=? addr=? terminal=? res=success' Jun 25 16:31:30.807869 sshd[1378]: pam_unix(sshd:session): session closed for user core Jun 25 16:31:30.811000 audit[1378]: USER_END pid=1378 uid=0 auid=500 ses=8 subj=system_u:system_r:kernel_t:s0 msg='op=PAM:session_close grantors=pam_loginuid,pam_env,pam_lastlog,pam_limits,pam_env,pam_unix,pam_permit,pam_systemd,pam_mail acct="core" exe="/usr/sbin/sshd" hostname=172.24.4.1 addr=172.24.4.1 terminal=ssh res=success' Jun 25 16:31:30.818472 kernel: audit: type=1106 audit(1719333090.811:192): pid=1378 uid=0 auid=500 ses=8 subj=system_u:system_r:kernel_t:s0 msg='op=PAM:session_close grantors=pam_loginuid,pam_env,pam_lastlog,pam_limits,pam_env,pam_unix,pam_permit,pam_systemd,pam_mail acct="core" exe="/usr/sbin/sshd" hostname=172.24.4.1 addr=172.24.4.1 terminal=ssh res=success' Jun 25 16:31:30.811000 audit[1378]: CRED_DISP pid=1378 uid=0 auid=500 ses=8 subj=system_u:system_r:kernel_t:s0 msg='op=PAM:setcred grantors=pam_env,pam_faillock,pam_unix acct="core" exe="/usr/sbin/sshd" hostname=172.24.4.1 addr=172.24.4.1 terminal=ssh res=success' Jun 25 16:31:30.825161 kernel: audit: type=1104 audit(1719333090.811:193): pid=1378 uid=0 auid=500 ses=8 subj=system_u:system_r:kernel_t:s0 msg='op=PAM:setcred grantors=pam_env,pam_faillock,pam_unix acct="core" exe="/usr/sbin/sshd" hostname=172.24.4.1 addr=172.24.4.1 terminal=ssh res=success' Jun 25 16:31:30.824676 systemd[1]: sshd@7-172.24.4.212:22-172.24.4.1:55888.service: Deactivated successfully. Jun 25 16:31:30.824000 audit[1]: SERVICE_STOP pid=1 uid=0 auid=4294967295 ses=4294967295 subj=system_u:system_r:kernel_t:s0 msg='unit=sshd@7-172.24.4.212:22-172.24.4.1:55888 comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Jun 25 16:31:30.826198 systemd[1]: session-8.scope: Deactivated successfully. Jun 25 16:31:30.831839 kernel: audit: type=1131 audit(1719333090.824:194): pid=1 uid=0 auid=4294967295 ses=4294967295 subj=system_u:system_r:kernel_t:s0 msg='unit=sshd@7-172.24.4.212:22-172.24.4.1:55888 comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Jun 25 16:31:30.831126 systemd-logind[1188]: Session 8 logged out. Waiting for processes to exit. Jun 25 16:31:30.840692 systemd[1]: Started sshd@8-172.24.4.212:22-172.24.4.1:55894.service - OpenSSH per-connection server daemon (172.24.4.1:55894). Jun 25 16:31:30.845729 systemd-logind[1188]: Removed session 8. Jun 25 16:31:30.840000 audit[1]: SERVICE_START pid=1 uid=0 auid=4294967295 ses=4294967295 subj=system_u:system_r:kernel_t:s0 msg='unit=sshd@8-172.24.4.212:22-172.24.4.1:55894 comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Jun 25 16:31:31.969000 audit[1408]: USER_ACCT pid=1408 uid=0 auid=4294967295 ses=4294967295 subj=system_u:system_r:kernel_t:s0 msg='op=PAM:accounting grantors=pam_access,pam_unix,pam_faillock,pam_permit acct="core" exe="/usr/sbin/sshd" hostname=172.24.4.1 addr=172.24.4.1 terminal=ssh res=success' Jun 25 16:31:31.971543 sshd[1408]: Accepted publickey for core from 172.24.4.1 port 55894 ssh2: RSA SHA256:28OIdiFmM2tDKGFH/eV86Nr5Hdswek2nBOxwiGuzcsE Jun 25 16:31:31.972000 audit[1408]: CRED_ACQ pid=1408 uid=0 auid=4294967295 ses=4294967295 subj=system_u:system_r:kernel_t:s0 msg='op=PAM:setcred grantors=pam_env,pam_faillock,pam_unix acct="core" exe="/usr/sbin/sshd" hostname=172.24.4.1 addr=172.24.4.1 terminal=ssh res=success' Jun 25 16:31:31.972000 audit[1408]: SYSCALL arch=c000003e syscall=1 success=yes exit=3 a0=5 a1=7ffdf1ea96c0 a2=3 a3=7fa8b6164480 items=0 ppid=1 pid=1408 auid=500 uid=0 gid=0 euid=0 suid=0 fsuid=0 egid=0 sgid=0 fsgid=0 tty=(none) ses=9 comm="sshd" exe="/usr/sbin/sshd" subj=system_u:system_r:kernel_t:s0 key=(null) Jun 25 16:31:31.972000 audit: PROCTITLE proctitle=737368643A20636F7265205B707269765D Jun 25 16:31:31.974923 sshd[1408]: pam_unix(sshd:session): session opened for user core(uid=500) by (uid=0) Jun 25 16:31:31.984508 systemd-logind[1188]: New session 9 of user core. Jun 25 16:31:31.992756 systemd[1]: Started session-9.scope - Session 9 of User core. Jun 25 16:31:32.003000 audit[1408]: USER_START pid=1408 uid=0 auid=500 ses=9 subj=system_u:system_r:kernel_t:s0 msg='op=PAM:session_open grantors=pam_loginuid,pam_env,pam_lastlog,pam_limits,pam_env,pam_unix,pam_permit,pam_systemd,pam_mail acct="core" exe="/usr/sbin/sshd" hostname=172.24.4.1 addr=172.24.4.1 terminal=ssh res=success' Jun 25 16:31:32.007000 audit[1410]: CRED_ACQ pid=1410 uid=0 auid=500 ses=9 subj=system_u:system_r:kernel_t:s0 msg='op=PAM:setcred grantors=pam_env,pam_faillock,pam_unix acct="core" exe="/usr/sbin/sshd" hostname=172.24.4.1 addr=172.24.4.1 terminal=ssh res=success' Jun 25 16:31:32.441000 audit[1413]: USER_ACCT pid=1413 uid=500 auid=500 ses=9 subj=system_u:system_r:kernel_t:s0 msg='op=PAM:accounting grantors=pam_unix,pam_faillock,pam_permit acct="core" exe="/usr/bin/sudo" hostname=? addr=? terminal=? res=success' Jun 25 16:31:32.442919 sudo[1413]: core : PWD=/home/core ; USER=root ; COMMAND=/usr/bin/tee /etc/flatcar/update.conf Jun 25 16:31:32.441000 audit[1413]: CRED_REFR pid=1413 uid=500 auid=500 ses=9 subj=system_u:system_r:kernel_t:s0 msg='op=PAM:setcred grantors=pam_env,pam_faillock,pam_unix acct="root" exe="/usr/bin/sudo" hostname=? addr=? terminal=? res=success' Jun 25 16:31:32.443559 sudo[1413]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=500) Jun 25 16:31:32.445000 audit[1413]: USER_START pid=1413 uid=500 auid=500 ses=9 subj=system_u:system_r:kernel_t:s0 msg='op=PAM:session_open grantors=pam_limits,pam_env,pam_unix,pam_permit,pam_systemd acct="root" exe="/usr/bin/sudo" hostname=? addr=? terminal=? res=success' Jun 25 16:31:32.452363 sudo[1413]: pam_unix(sudo:session): session closed for user root Jun 25 16:31:32.451000 audit[1413]: USER_END pid=1413 uid=500 auid=500 ses=9 subj=system_u:system_r:kernel_t:s0 msg='op=PAM:session_close grantors=pam_limits,pam_env,pam_unix,pam_permit,pam_systemd acct="root" exe="/usr/bin/sudo" hostname=? addr=? terminal=? res=success' Jun 25 16:31:32.451000 audit[1413]: CRED_DISP pid=1413 uid=500 auid=500 ses=9 subj=system_u:system_r:kernel_t:s0 msg='op=PAM:setcred grantors=pam_env,pam_faillock,pam_unix acct="root" exe="/usr/bin/sudo" hostname=? addr=? terminal=? res=success' Jun 25 16:31:32.467103 systemd[1]: Starting motdgen.service - Generate /run/flatcar/motd... Jun 25 16:31:32.488189 systemd[1]: motdgen.service: Deactivated successfully. Jun 25 16:31:32.488583 systemd[1]: Finished motdgen.service - Generate /run/flatcar/motd. Jun 25 16:31:32.487000 audit[1]: SERVICE_START pid=1 uid=0 auid=4294967295 ses=4294967295 subj=system_u:system_r:kernel_t:s0 msg='unit=motdgen comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Jun 25 16:31:32.487000 audit[1]: SERVICE_STOP pid=1 uid=0 auid=4294967295 ses=4294967295 subj=system_u:system_r:kernel_t:s0 msg='unit=motdgen comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Jun 25 16:31:32.747092 sshd[1408]: pam_unix(sshd:session): session closed for user core Jun 25 16:31:32.748000 audit[1408]: USER_END pid=1408 uid=0 auid=500 ses=9 subj=system_u:system_r:kernel_t:s0 msg='op=PAM:session_close grantors=pam_loginuid,pam_env,pam_lastlog,pam_limits,pam_env,pam_unix,pam_permit,pam_systemd,pam_mail acct="core" exe="/usr/sbin/sshd" hostname=172.24.4.1 addr=172.24.4.1 terminal=ssh res=success' Jun 25 16:31:32.748000 audit[1408]: CRED_DISP pid=1408 uid=0 auid=500 ses=9 subj=system_u:system_r:kernel_t:s0 msg='op=PAM:setcred grantors=pam_env,pam_faillock,pam_unix acct="core" exe="/usr/sbin/sshd" hostname=172.24.4.1 addr=172.24.4.1 terminal=ssh res=success' Jun 25 16:31:32.752595 systemd[1]: sshd@8-172.24.4.212:22-172.24.4.1:55894.service: Deactivated successfully. Jun 25 16:31:32.751000 audit[1]: SERVICE_STOP pid=1 uid=0 auid=4294967295 ses=4294967295 subj=system_u:system_r:kernel_t:s0 msg='unit=sshd@8-172.24.4.212:22-172.24.4.1:55894 comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Jun 25 16:31:32.754103 systemd[1]: session-9.scope: Deactivated successfully. Jun 25 16:31:32.755650 systemd-logind[1188]: Session 9 logged out. Waiting for processes to exit. Jun 25 16:31:32.757853 systemd-logind[1188]: Removed session 9. Jun 25 16:31:35.397573 systemd[1]: systemd-hostnamed.service: Deactivated successfully. Jun 25 16:31:35.396000 audit[1]: SERVICE_STOP pid=1 uid=0 auid=4294967295 ses=4294967295 subj=system_u:system_r:kernel_t:s0 msg='unit=systemd-hostnamed comm="systemd" exe="/usr/lib/systemd/systemd" hostname=? addr=? terminal=? res=success' Jun 25 16:31:35.413000 audit: BPF prog-id=60 op=UNLOAD Jun 25 16:31:35.413000 audit: BPF prog-id=59 op=UNLOAD Jun 25 16:31:35.413000 audit: BPF prog-id=58 op=UNLOAD