vm-test-run-ncps
checks.aarch64-linux.ncps
· build #884
· raw
1build01: building 8x0wlbh5cjxjwkj53sxnwjc9wcj8x0zp-vm-test-run-ncps.drv2Machine state will be reset. To keep it, pass --keep-machine-state3start all VLans4(finished: start all VLans, in 0.00 seconds)5Test will time out and terminate in 3600.0 seconds6run the VM test script7additionally exposed symbols:8 alice, bob, clare,9 vlan1,10 start_all, test_script, machines, machines_qemu, machines_nspawn, vlans, driver, log, os, create_machine, subtest, run_tests, join_all, retry, serial_stdout_off, serial_stdout_on, polling_condition, BaseMachine, QemuMachine, NspawnMachine, t, debug, dump_machine_ssh11start all VMs12alice: starting vm13bob: starting vm14clare: starting vm15clare: QEMU running (pid 50)16clare # Disk image does not exist, creating the virtualisation disk image...17alice: QEMU running (pid 48)18clare # Formatting '/build/vm-state-clare/tmp.vb4czSn8q2', fmt=raw size=107374182419alice # Disk image does not exist, creating the virtualisation disk image...20clare # mke2fs 1.47.4 (6-Mar-2025)21alice # Formatting '/build/vm-state-alice/tmp.UKxrTordt9', fmt=raw size=107374182422clare # Discarding device blocks: 0/262144 done23alice # mke2fs 1.47.4 (6-Mar-2025)24bob # Disk image does not exist, creating the virtualisation disk image...25bob: QEMU running (pid 49)26clare # Creating filesystem with 262144 4k blocks and 65536 inodes27alice # Discarding device blocks: 0/262144 done28clare # Filesystem UUID: 3c03a584-5778-40ca-89c8-804af6ee8a0c29bob # Formatting '/build/vm-state-bob/tmp.H8E0y4n6uI', fmt=raw size=107374182430alice # Creating filesystem with 262144 4k blocks and 65536 inodes31bob # mke2fs 1.47.4 (6-Mar-2025)32(finished: start all VMs, in 0.51 seconds)33clare # Superblock backups stored on blocks:34bob # Discarding device blocks: 0/262144 done35bob: waiting for unit ncps36clare # 32768, 98304, 163840, 22937637bob # Creating filesystem with 262144 4k blocks and 65536 inodes38bob: waiting for the VM to finish booting39alice # Filesystem UUID: 50142622-57b5-4dfa-9490-28a1b3a21de140clare # 41bob # Filesystem UUID: dceae672-475b-4dbd-a218-398d406d48e042clare # Allocating group tables: 0/8 done43bob # Superblock backups stored on blocks:44clare # Writing inode tables: 0/8 done45bob # 32768, 98304, 163840, 22937646clare # Creating journal (8192 blocks): done47bob # 48clare # Writing superblocks and filesystem accounting information: 0/8 done49bob # Allocating group tables: 0/8 done50clare # 51alice # Superblock backups stored on blocks:52bob # Writing inode tables: 0/8 done53alice # 32768, 98304, 163840, 22937654bob # Creating journal (8192 blocks): done55alice # 56bob # Writing superblocks and filesystem accounting information: 0/8 done57alice # Allocating group tables: 0/8 done58bob # 59alice # Writing inode tables: 0/8 done60bob # Virtualisation disk image created.61alice # Creating journal (8192 blocks): done62bob # Starting virtiofs daemons...63alice # Writing superblocks and filesystem accounting information: 0/8 done64bob # [2026-10-07T05:20:47Z WARN virtiofsd::passthrough] Failed to open file handle for the root node: Operation not permitted (os error 1)65alice # 66bob # [2026-10-07T05:20:47Z WARN virtiofsd::passthrough] Failed to open file handle for the root node: Operation not permitted (os error 1)67alice # Virtualisation disk image created.68bob # [2026-10-07T05:20:47Z WARN virtiofsd::passthrough] File handles do not appear safe to use, disabling file handles altogether69alice # Starting virtiofs daemons...70bob # [2026-10-07T05:20:47Z WARN virtiofsd::passthrough] File handles do not appear safe to use, disabling file handles altogether71alice # [2026-10-07T05:20:47Z WARN virtiofsd::passthrough] Failed to open file handle for the root node: Operation not permitted (os error 1)72bob # [2026-10-07T05:20:47Z WARN virtiofsd::passthrough] Failed to open file handle for the root node: Operation not permitted (os error 1)73alice # [2026-10-07T05:20:47Z WARN virtiofsd::passthrough] File handles do not appear safe to use, disabling file handles altogether74bob # [2026-10-07T05:20:47Z WARN virtiofsd::passthrough] File handles do not appear safe to use, disabling file handles altogether75alice # [2026-10-07T05:20:47Z INFO virtiofsd] Waiting for vhost-user socket connection...76bob # [2026-10-07T05:20:47Z INFO virtiofsd] Waiting for vhost-user socket connection...77alice # [2026-10-07T05:20:47Z WARN virtiofsd::passthrough] Failed to open file handle for the root node: Operation not permitted (os error 1)78bob # [2026-10-07T05:20:47Z INFO virtiofsd] Waiting for vhost-user socket connection...79alice # [2026-10-07T05:20:47Z WARN virtiofsd::passthrough] File handles do not appear safe to use, disabling file handles altogether80bob # [2026-10-07T05:20:47Z INFO virtiofsd] Waiting for vhost-user socket connection...81alice # [2026-10-07T05:20:47Z INFO virtiofsd] Waiting for vhost-user socket connection...82bob # [2026-10-07T05:20:47Z INFO virtiofsd] Client connected, servicing requests83alice # [2026-10-07T05:20:47Z WARN virtiofsd::passthrough] Failed to open file handle for the root node: Operation not permitted (os error 1)84bob # [2026-10-07T05:20:47Z INFO virtiofsd] Client connected, servicing requests85alice # [2026-10-07T05:20:47Z WARN virtiofsd::passthrough] File handles do not appear safe to use, disabling file handles altogether86bob # [2026-10-07T05:20:47Z INFO virtiofsd] Client connected, servicing requests87alice # [2026-10-07T05:20:47Z INFO virtiofsd] Waiting for vhost-user socket connection...88clare # Virtualisation disk image created.89alice # [2026-10-07T05:20:47Z INFO virtiofsd] Client connected, servicing requests90clare # Starting virtiofs daemons...91alice # [2026-10-07T05:20:47Z INFO virtiofsd] Client connected, servicing requests92clare # [2026-10-07T05:20:47Z WARN virtiofsd::passthrough] Failed to open file handle for the root node: Operation not permitted (os error 1)93alice # [2026-10-07T05:20:47Z INFO virtiofsd] Client connected, servicing requests94clare # [2026-10-07T05:20:47Z WARN virtiofsd::passthrough] File handles do not appear safe to use, disabling file handles altogether95clare # [2026-10-07T05:20:47Z INFO virtiofsd] Waiting for vhost-user socket connection...96clare # [2026-10-07T05:20:47Z WARN virtiofsd::passthrough] Failed to open file handle for the root node: Operation not permitted (os error 1)97clare # [2026-10-07T05:20:47Z WARN virtiofsd::passthrough] File handles do not appear safe to use, disabling file handles altogether98clare # [2026-10-07T05:20:47Z INFO virtiofsd] Waiting for vhost-user socket connection...99clare # [2026-10-07T05:20:47Z WARN virtiofsd::passthrough] Failed to open file handle for the root node: Operation not permitted (os error 1)100clare # [2026-10-07T05:20:47Z WARN virtiofsd::passthrough] File handles do not appear safe to use, disabling file handles altogether101clare # [2026-10-07T05:20:47Z INFO virtiofsd] Waiting for vhost-user socket connection...102clare # [2026-10-07T05:20:47Z INFO virtiofsd] Client connected, servicing requests103clare # [2026-10-07T05:20:47Z INFO virtiofsd] Client connected, servicing requests104clare # [2026-10-07T05:20:47Z INFO virtiofsd] Client connected, servicing requests105clare # [ 0.000000] Booting Linux on physical CPU 0x0000000000 [0x413fd0c1]106clare # [ 0.000000] Linux version 6.18.55 (nixbld@localhost) (gcc (GCC) 16.2.0, GNU ld (GNU Binutils) 2.46) #1-NixOS SMP PREEMPT Sat Oct 3 10:39:03 UTC 2026107clare # [ 0.000000] KASLR enabled108clare # [ 0.000000] random: crng init done109clare # [ 0.000000] Machine model: linux,dummy-virt110clare # [ 0.000000] efi: UEFI not found.111clare # [ 0.000000] OF: reserved mem: Reserved memory: No reserved-memory node in the DT112clare # [ 0.000000] NUMA: Faking a node at [mem 0x0000000040000000-0x000000007fffffff]113clare # [ 0.000000] NODE_DATA(0) allocated [mem 0x7fc08700-0x7fc0be7f]114clare # [ 0.000000] Zone ranges:115clare # [ 0.000000] DMA [mem 0x0000000040000000-0x000000007fffffff]116clare # [ 0.000000] DMA32 empty117clare # [ 0.000000] Normal empty118clare # [ 0.000000] Device empty119clare # [ 0.000000] Movable zone start for each node120clare # [ 0.000000] Early memory node ranges121clare # [ 0.000000] node 0: [mem 0x0000000040000000-0x000000007fffffff]122clare # [ 0.000000] Initmem setup node 0 [mem 0x0000000040000000-0x000000007fffffff]123clare # [ 0.000000] cma: Reserved 32 MiB at 0x000000007ca00000124clare # [ 0.000000] psci: probing for conduit method from DT.125clare # [ 0.000000] psci: PSCIv1.3 detected in firmware.126clare # [ 0.000000] psci: Using standard PSCI v0.2 function IDs127clare # [ 0.000000] psci: Trusted OS migration not required128clare # [ 0.000000] psci: SMC Calling Convention v1.1129clare # [ 0.000000] smccc: KVM: hypervisor services detected (0x00000000 0x00000000 0x00000000 0x00000003)130clare # [ 0.000000] percpu: Embedded 76 pages/cpu s186840 r8192 d116264 u311296131clare # [ 0.000000] Detected PIPT I-cache on CPU0132clare # [ 0.000000] CPU features: detected: GICv3 CPU interface133clare # [ 0.000000] CPU features: detected: Spectre-v4134clare # [ 0.000000] CPU features: detected: Spectre-BHB135clare # [ 0.000000] CPU features: kernel page table isolation forced ON by KASLR136clare # [ 0.000000] CPU features: detected: Kernel page table isolation (KPTI)137clare # [ 0.000000] CPU features: detected: ARM erratum 1418040138clare # [ 0.000000] CPU features: detected: Broken broadcast TLBI completion139clare # [ 0.000000] CPU features: detected: SSBS not fully self-synchronizing140clare # [ 0.000000] alternatives: applying boot alternatives141clare # [ 0.000000] Kernel command line: console=ttyAMA0 console=tty0 panic=1 boot.panic_on_fail clocksource=acpi_pm root=fstab loglevel=7 net.ifnames=0 lsm=landlock,yama,bpf init=/nix/store/pz32wfgyriqbvmxl7nchdj3rlpir4vwl-nixos-system-clare-test/init regInfo=/nix/.ro-store/7p8wgmr5hzx6r6y0akpzw1i7i78nv2sq-closure-info/registration console=ttyAMA0,115200n8 console=tty0142bob # [ 0.000000] Booting Linux on physical CPU 0x0000000000 [0x413fd0c1]143clare # [ 0.000000] Unknown kernel command line parameters "regInfo=/nix/.ro-store/7p8wgmr5hzx6r6y0akpzw1i7i78nv2sq-closure-info/registration", will be passed to user space.144clare # [ 0.000000] printk: log buffer data + meta data: 131072 + 458752 = 589824 bytes145bob # [ 0.000000] Linux version 6.18.55 (nixbld@localhost) (gcc (GCC) 16.2.0, GNU ld (GNU Binutils) 2.46) #1-NixOS SMP PREEMPT Sat Oct 3 10:39:03 UTC 2026146bob # [ 0.000000] KASLR enabled147bob # [ 0.000000] random: crng init done148clare # [ 0.000000] Dentry cache hash table entries: 131072 (order: 8, 1048576 bytes, linear)149bob # [ 0.000000] Machine model: linux,dummy-virt150bob # [ 0.000000] efi: UEFI not found.151clare # [ 0.000000] Inode-cache hash table entries: 65536 (order: 7, 524288 bytes, linear)152alice # [ 0.000000] Booting Linux on physical CPU 0x0000000000 [0x413fd0c1]153bob # [ 0.000000] OF: reserved mem: Reserved memory: No reserved-memory node in the DT154clare # [ 0.000000] software IO TLB: SWIOTLB bounce buffer size adjusted to 1MB155clare # [ 0.000000] software IO TLB: area num 1.156bob # [ 0.000000] NUMA: Faking a node at [mem 0x0000000040000000-0x000000007fffffff]157clare # [ 0.000000] software IO TLB: mapped [mem 0x000000007c900000-0x000000007ca00000] (1MB)158alice # [ 0.000000] Linux version 6.18.55 (nixbld@localhost) (gcc (GCC) 16.2.0, GNU ld (GNU Binutils) 2.46) #1-NixOS SMP PREEMPT Sat Oct 3 10:39:03 UTC 2026159bob # [ 0.000000] NODE_DATA(0) allocated [mem 0x7fc08700-0x7fc0be7f]160alice # [ 0.000000] KASLR enabled161clare # [ 0.000000] Fallback order for Node 0: 0162bob # [ 0.000000] Zone ranges:163alice # [ 0.000000] random: crng init done164bob # [ 0.000000] DMA [mem 0x0000000040000000-0x000000007fffffff]165clare # [ 0.000000] Built 1 zonelists, mobility grouping on. Total pages: 262144166alice # [ 0.000000] Machine model: linux,dummy-virt167bob # [ 0.000000] DMA32 empty168clare # [ 0.000000] Policy zone: DMA169alice # [ 0.000000] efi: UEFI not found.170bob # [ 0.000000] Normal empty171bob # [ 0.000000] Device empty172clare # [ 0.000000] mem auto-init: stack:all(zero), heap alloc:on, heap free:off173alice # [ 0.000000] OF: reserved mem: Reserved memory: No reserved-memory node in the DT174bob # [ 0.000000] Movable zone start for each node175bob # [ 0.000000] Early memory node ranges176clare # [ 0.000000] SLUB: HWalign=64, Order=0-3, MinObjects=0, CPUs=1, Nodes=1177alice # [ 0.000000] NUMA: Faking a node at [mem 0x0000000040000000-0x000000007fffffff]178clare # [ 0.000000] allocated 2097152 bytes of page_ext179bob # [ 0.000000] node 0: [mem 0x0000000040000000-0x000000007fffffff]180alice # [ 0.000000] NODE_DATA(0) allocated [mem 0x7fc08700-0x7fc0be7f]181clare # [ 0.000000] ftrace: allocating 75039 entries in 294 pages182alice # [ 0.000000] Zone ranges:183bob # [ 0.000000] Initmem setup node 0 [mem 0x0000000040000000-0x000000007fffffff]184clare # [ 0.000000] ftrace: allocated 294 pages with 4 groups185alice # [ 0.000000] DMA [mem 0x0000000040000000-0x000000007fffffff]186bob # [ 0.000000] cma: Reserved 32 MiB at 0x000000007ca00000187alice # [ 0.000000] DMA32 empty188clare # [ 0.000000] rcu: Hierarchical RCU implementation.189alice # [ 0.000000] Normal empty190bob # [ 0.000000] psci: probing for conduit method from DT.191clare # [ 0.000000] rcu: RCU event tracing is enabled.192alice # [ 0.000000] Device empty193bob # [ 0.000000] psci: PSCIv1.3 detected in firmware.194alice # [ 0.000000] Movable zone start for each node195clare # [ 0.000000] rcu: RCU restricting CPUs from NR_CPUS=384 to nr_cpu_ids=1.196bob # [ 0.000000] psci: Using standard PSCI v0.2 function IDs197alice # [ 0.000000] Early memory node ranges198clare # [ 0.000000] Trampoline variant of Tasks RCU enabled.199bob # [ 0.000000] psci: Trusted OS migration not required200alice # [ 0.000000] node 0: [mem 0x0000000040000000-0x000000007fffffff]201clare # [ 0.000000] Rude variant of Tasks RCU enabled.202bob # [ 0.000000] psci: SMC Calling Convention v1.1203clare # [ 0.000000] Tracing variant of Tasks RCU enabled.204alice # [ 0.000000] Initmem setup node 0 [mem 0x0000000040000000-0x000000007fffffff]205bob # [ 0.000000] smccc: KVM: hypervisor services detected (0x00000000 0x00000000 0x00000000 0x00000003)206alice # [ 0.000000] cma: Reserved 32 MiB at 0x000000007ca00000207clare # [ 0.000000] rcu: RCU calculated value of scheduler-enlistment delay is 25 jiffies.208alice # [ 0.000000] psci: probing for conduit method from DT.209bob # [ 0.000000] percpu: Embedded 76 pages/cpu s186840 r8192 d116264 u311296210clare # [ 0.000000] rcu: Adjusting geometry for rcu_fanout_leaf=16, nr_cpu_ids=1211alice # [ 0.000000] psci: PSCIv1.3 detected in firmware.212bob # [ 0.000000] Detected PIPT I-cache on CPU0213alice # [ 0.000000] psci: Using standard PSCI v0.2 function IDs214bob # [ 0.000000] CPU features: detected: GICv3 CPU interface215clare # [ 0.000000] RCU Tasks: Setting shift to 0 and lim to 1 rcu_task_cb_adjust=1 rcu_task_cpu_ids=1.216alice # [ 0.000000] psci: Trusted OS migration not required217bob # [ 0.000000] CPU features: detected: Spectre-v4218alice # [ 0.000000] psci: SMC Calling Convention v1.1219bob # [ 0.000000] CPU features: detected: Spectre-BHB220clare # [ 0.000000] RCU Tasks Rude: Setting shift to 0 and lim to 1 rcu_task_cb_adjust=1 rcu_task_cpu_ids=1.221bob # [ 0.000000] CPU features: kernel page table isolation forced ON by KASLR222alice # [ 0.000000] smccc: KVM: hypervisor services detected (0x00000000 0x00000000 0x00000000 0x00000003)223clare # [ 0.000000] RCU Tasks Trace: Setting shift to 0 and lim to 1 rcu_task_cb_adjust=1 rcu_task_cpu_ids=1.224bob # [ 0.000000] CPU features: detected: Kernel page table isolation (KPTI)225clare # [ 0.000000] NR_IRQS: 64, nr_irqs: 64, preallocated irqs: 0226alice # [ 0.000000] percpu: Embedded 76 pages/cpu s186840 r8192 d116264 u311296227bob # [ 0.000000] CPU features: detected: ARM erratum 1418040228clare # [ 0.000000] GICv3: 256 SPIs implemented229alice # [ 0.000000] Detected PIPT I-cache on CPU0230clare # [ 0.000000] GICv3: 0 Extended SPIs implemented231bob # [ 0.000000] CPU features: detected: Broken broadcast TLBI completion232alice # [ 0.000000] CPU features: detected: GICv3 CPU interface233clare # [ 0.000000] Root IRQ handler: gic_handle_irq234alice # [ 0.000000] CPU features: detected: Spectre-v4235bob # [ 0.000000] CPU features: detected: SSBS not fully self-synchronizing236clare # [ 0.000000] GICv3: GICv3 features: 16 PPIs, DirectLPI237alice # [ 0.000000] CPU features: detected: Spectre-BHB238bob # [ 0.000000] alternatives: applying boot alternatives239clare # [ 0.000000] GICv3: GICD_CTLR.DS=1, SCR_EL3.FIQ=0240alice # [ 0.000000] CPU features: kernel page table isolation forced ON by KASLR241clare # [ 0.000000] GICv3: CPU0: found redistributor 0 region 0:0x00000000080a0000242alice # [ 0.000000] CPU features: detected: Kernel page table isolation (KPTI)243clare # [ 0.000000] ITS [mem 0x08080000-0x0809ffff]244alice # [ 0.000000] CPU features: detected: ARM erratum 1418040245clare # [ 0.000000] ITS@0x0000000008080000: allocated 8192 Devices @44cf0000 (indirect, esz 8, psz 64K, shr 1)246alice # [ 0.000000] CPU features: detected: Broken broadcast TLBI completion247alice # [ 0.000000] CPU features: detected: SSBS not fully self-synchronizing248clare # [ 0.000000] ITS@0x0000000008080000: allocated 8192 Interrupt Collections @44d00000 (flat, esz 8, psz 64K, shr 1)249alice # [ 0.000000] alternatives: applying boot alternatives250bob # [ 0.000000] Kernel command line: console=ttyAMA0 console=tty0 panic=1 boot.panic_on_fail clocksource=acpi_pm root=fstab loglevel=7 net.ifnames=0 lsm=landlock,yama,bpf init=/nix/store/vd8qkla9gq340l9f8ily9my4z20h0px6-nixos-system-bob-test/init regInfo=/nix/.ro-store/lnq6syj90jc8ia27fks0dcxczwin88wj-closure-info/registration console=ttyAMA0,115200n8 console=tty0251clare # [ 0.000000] GICv3: using LPI property table @0x0000000044d10000252clare # [ 0.000000] GICv3: CPU0: using allocated LPI pending table @0x0000000044d20000253bob # [ 0.000000] Unknown kernel command line parameters "regInfo=/nix/.ro-store/lnq6syj90jc8ia27fks0dcxczwin88wj-closure-info/registration", will be passed to user space.254clare # [ 0.000000] rcu: srcu_init: Setting srcu_struct sizes based on contention.255bob # [ 0.000000] printk: log buffer data + meta data: 131072 + 458752 = 589824 bytes256clare # [ 0.000000] clocksource: jiffies: mask: 0xffffffff max_cycles: 0xffffffff, max_idle_ns: 7645041785100000 ns257bob # [ 0.000000] Dentry cache hash table entries: 131072 (order: 8, 1048576 bytes, linear)258clare # [ 0.000000] arch_timer: Enabling local workaround for ARM erratum 1418040259alice # [ 0.000000] Kernel command line: console=ttyAMA0 console=tty0 panic=1 boot.panic_on_fail clocksource=acpi_pm root=fstab loglevel=7 net.ifnames=0 lsm=landlock,yama,bpf init=/nix/store/xp1n05bw700zw1i0y8x199f0abc3ij9n-nixos-system-alice-test/init regInfo=/nix/.ro-store/wigmyb0c46y497rg9m7mffjmwz48frhc-closure-info/registration console=ttyAMA0,115200n8 console=tty0260bob # [ 0.000000] Inode-cache hash table entries: 65536 (order: 7, 524288 bytes, linear)261clare # [ 0.000000] arch_timer: cp15 timer running at 25.00MHz (virt).262bob # [ 0.000000] software IO TLB: SWIOTLB bounce buffer size adjusted to 1MB263bob # [ 0.000000] software IO TLB: area num 1.264clare # [ 0.000000] clocksource: arch_sys_counter: mask: 0xffffffffffffff max_cycles: 0x5c40939b5, max_idle_ns: 440795202646 ns265alice # [ 0.000000] Unknown kernel command line parameters "regInfo=/nix/.ro-store/wigmyb0c46y497rg9m7mffjmwz48frhc-closure-info/registration", will be passed to user space.266bob # [ 0.000000] software IO TLB: mapped [mem 0x000000007c900000-0x000000007ca00000] (1MB)267clare # [ 0.000000] sched_clock: 56 bits at 25MHz, resolution 40ns, wraps every 4398046511100ns268alice # [ 0.000000] printk: log buffer data + meta data: 131072 + 458752 = 589824 bytes269bob # [ 0.000000] Fallback order for Node 0: 0270clare # [ 0.000056] arm-pv: using stolen time PV271alice # [ 0.000000] Dentry cache hash table entries: 131072 (order: 8, 1048576 bytes, linear)272bob # [ 0.000000] Built 1 zonelists, mobility grouping on. Total pages: 262144273bob # [ 0.000000] Policy zone: DMA274clare # [ 0.000390] kfence: initialized - using 2097152 bytes for 255 objects at 0x(____ptrval____)-0x(____ptrval____)275alice # [ 0.000000] Inode-cache hash table entries: 65536 (order: 7, 524288 bytes, linear)276clare # [ 0.000694] Console: colour dummy device 80x25277bob # [ 0.000000] mem auto-init: stack:all(zero), heap alloc:on, heap free:off278alice # [ 0.000000] software IO TLB: SWIOTLB bounce buffer size adjusted to 1MB279clare # [ 0.000706] printk: legacy console [tty0] enabled280bob # [ 0.000000] SLUB: HWalign=64, Order=0-3, MinObjects=0, CPUs=1, Nodes=1281alice # [ 0.000000] software IO TLB: area num 1.282bob # [ 0.000000] allocated 2097152 bytes of page_ext283clare # [ 0.000927] Calibrating delay loop (skipped), value calculated using timer frequency.. 50.00 BogoMIPS (lpj=100000)284alice # [ 0.000000] software IO TLB: mapped [mem 0x000000007c900000-0x000000007ca00000] (1MB)285bob # [ 0.000000] ftrace: allocating 75039 entries in 294 pages286clare # [ 0.000933] pid_max: default: 32768 minimum: 301287alice # [ 0.000000] Fallback order for Node 0: 0288bob # [ 0.000000] ftrace: allocated 294 pages with 4 groups289clare # [ 0.001010] LSM: initializing lsm=capability,landlock,yama,bpf,ima290alice # [ 0.000000] Built 1 zonelists, mobility grouping on. Total pages: 262144291bob # [ 0.000000] rcu: Hierarchical RCU implementation.292clare # [ 0.001159] landlock: Up and running.293alice # [ 0.000000] Policy zone: DMA294bob # [ 0.000000] rcu: RCU event tracing is enabled.295clare # [ 0.001162] Yama: becoming mindful.296clare # [ 0.001568] LSM support for eBPF active297alice # [ 0.000000] mem auto-init: stack:all(zero), heap alloc:on, heap free:off298bob # [ 0.000000] rcu: RCU restricting CPUs from NR_CPUS=384 to nr_cpu_ids=1.299alice # [ 0.000000] SLUB: HWalign=64, Order=0-3, MinObjects=0, CPUs=1, Nodes=1300clare # [ 0.001741] Mount-cache hash table entries: 2048 (order: 2, 16384 bytes, linear)301bob # [ 0.000000] Trampoline variant of Tasks RCU enabled.302alice # [ 0.000000] allocated 2097152 bytes of page_ext303bob # [ 0.000000] Rude variant of Tasks RCU enabled.304clare # [ 0.001760] Mountpoint-cache hash table entries: 2048 (order: 2, 16384 bytes, linear)305alice # [ 0.000000] ftrace: allocating 75039 entries in 294 pages306bob # [ 0.000000] Tracing variant of Tasks RCU enabled.307clare # [ 0.004495] rcu: Hierarchical SRCU implementation.308alice # [ 0.000000] ftrace: allocated 294 pages with 4 groups309bob # [ 0.000000] rcu: RCU calculated value of scheduler-enlistment delay is 25 jiffies.310clare # [ 0.004501] rcu: Max phase no-delay instances is 1000.311alice # [ 0.000000] rcu: Hierarchical RCU implementation.312clare # [ 0.005448] fsl-mc MSI: its@8080000 domain created313alice # [ 0.000000] rcu: RCU event tracing is enabled.314bob # [ 0.000000] rcu: Adjusting geometry for rcu_fanout_leaf=16, nr_cpu_ids=1315clare # [ 0.005647] EFI services will not be available.316alice # [ 0.000000] rcu: RCU restricting CPUs from NR_CPUS=384 to nr_cpu_ids=1.317clare # [ 0.005730] smp: Bringing up secondary CPUs ...318bob # [ 0.000000] RCU Tasks: Setting shift to 0 and lim to 1 rcu_task_cb_adjust=1 rcu_task_cpu_ids=1.319clare # [ 0.005762] smp: Brought up 1 node, 1 CPU320alice # [ 0.000000] Trampoline variant of Tasks RCU enabled.321alice # [ 0.000000] Rude variant of Tasks RCU enabled.322bob # [ 0.000000] RCU Tasks Rude: Setting shift to 0 and lim to 1 rcu_task_cb_adjust=1 rcu_task_cpu_ids=1.323clare # [ 0.005766] SMP: Total of 1 processors activated.324clare # [ 0.005768] CPU: All CPU(s) started at EL1325alice # [ 0.000000] Tracing variant of Tasks RCU enabled.326clare # [ 0.005780] CPU features: detected: 32-bit EL0 Support327bob # [ 0.000000] RCU Tasks Trace: Setting shift to 0 and lim to 1 rcu_task_cb_adjust=1 rcu_task_cpu_ids=1.328alice # [ 0.000000] rcu: RCU calculated value of scheduler-enlistment delay is 25 jiffies.329bob # [ 0.000000] NR_IRQS: 64, nr_irqs: 64, preallocated irqs: 0330clare # [ 0.005784] CPU features: detected: Data cache clean to the PoU not required for I/D coherence331alice # [ 0.000000] rcu: Adjusting geometry for rcu_fanout_leaf=16, nr_cpu_ids=1332bob # [ 0.000000] GICv3: 256 SPIs implemented333clare # [ 0.005786] CPU features: detected: Common not Private translations334bob # [ 0.000000] GICv3: 0 Extended SPIs implemented335alice # [ 0.000000] RCU Tasks: Setting shift to 0 and lim to 1 rcu_task_cb_adjust=1 rcu_task_cpu_ids=1.336bob # [ 0.000000] Root IRQ handler: gic_handle_irq337clare # [ 0.005788] CPU features: detected: CRC32 instructions338bob # [ 0.000000] GICv3: GICv3 features: 16 PPIs, DirectLPI339clare # [ 0.005790] CPU features: detected: Data cache clean to Point of Persistence340alice # [ 0.000000] RCU Tasks Rude: Setting shift to 0 and lim to 1 rcu_task_cb_adjust=1 rcu_task_cpu_ids=1.341bob # [ 0.000000] GICv3: GICD_CTLR.DS=1, SCR_EL3.FIQ=0342clare # [ 0.005793] CPU features: detected: Enhanced Virtualization Traps343bob # [ 0.000000] GICv3: CPU0: found redistributor 0 region 0:0x00000000080a0000344alice # [ 0.000000] RCU Tasks Trace: Setting shift to 0 and lim to 1 rcu_task_cb_adjust=1 rcu_task_cpu_ids=1.345bob # [ 0.000000] ITS [mem 0x08080000-0x0809ffff]346clare # [ 0.005804] CPU features: detected: RCpc load-acquire (LDAPR)347alice # [ 0.000000] NR_IRQS: 64, nr_irqs: 64, preallocated irqs: 0348clare # [ 0.005806] CPU features: detected: LSE atomic instructions349alice # [ 0.000000] GICv3: 256 SPIs implemented350bob # [ 0.000000] ITS@0x0000000008080000: allocated 8192 Devices @44cf0000 (indirect, esz 8, psz 64K, shr 1)351alice # [ 0.000000] GICv3: 0 Extended SPIs implemented352clare # [ 0.005808] CPU features: detected: Privileged Access Never353clare # [ 0.005810] CPU features: detected: PMUv3354alice # [ 0.000000] Root IRQ handler: gic_handle_irq355bob # [ 0.000000] ITS@0x0000000008080000: allocated 8192 Interrupt Collections @44d00000 (flat, esz 8, psz 64K, shr 1)356clare # [ 0.005812] CPU features: detected: RAS Extension Support357alice # [ 0.000000] GICv3: GICv3 features: 16 PPIs, DirectLPI358alice # [ 0.000000] GICv3: GICD_CTLR.DS=1, SCR_EL3.FIQ=0359bob # [ 0.000000] GICv3: using LPI property table @0x0000000044d10000360clare # [ 0.005815] CPU features: detected: Speculative Store Bypassing Safe (SSBS)361alice # [ 0.000000] GICv3: CPU0: found redistributor 0 region 0:0x00000000080a0000362clare # [ 0.005836] alternatives: applying system-wide alternatives363bob # [ 0.000000] GICv3: CPU0: using allocated LPI pending table @0x0000000044d20000364alice # [ 0.000000] ITS [mem 0x08080000-0x0809ffff]365clare # [ 0.007238] CPU features: detected: Hardware dirty bit management on CPU0366bob # [ 0.000000] rcu: srcu_init: Setting srcu_struct sizes based on contention.367alice # [ 0.000000] ITS@0x0000000008080000: allocated 8192 Devices @44cf0000 (indirect, esz 8, psz 64K, shr 1)368bob # [ 0.000000] clocksource: jiffies: mask: 0xffffffff max_cycles: 0xffffffff, max_idle_ns: 7645041785100000 ns369alice # [ 0.000000] ITS@0x0000000008080000: allocated 8192 Interrupt Collections @44d00000 (flat, esz 8, psz 64K, shr 1)370clare # [ 0.007439] Memory: 891116K/1048576K available (24576K kernel code, 7094K rwdata, 26568K rodata, 4736K init, 1106K bss, 116132K reserved, 32768K cma-reserved)371bob # [ 0.000000] arch_timer: Enabling local workaround for ARM erratum 1418040372clare # [ 0.007922] devtmpfs: initialized373alice # [ 0.000000] GICv3: using LPI property table @0x0000000044d10000374bob # [ 0.000000] arch_timer: cp15 timer running at 25.00MHz (virt).375clare # [ 0.009410] posixtimers hash table entries: 512 (order: 1, 8192 bytes, linear)376alice # [ 0.000000] GICv3: CPU0: using allocated LPI pending table @0x0000000044d20000377bob # [ 0.000000] clocksource: arch_sys_counter: mask: 0xffffffffffffff max_cycles: 0x5c40939b5, max_idle_ns: 440795202646 ns378clare # [ 0.009433] futex hash table entries: 256 (16384 bytes on 1 NUMA nodes, total 16 KiB, linear).379alice # [ 0.000000] rcu: srcu_init: Setting srcu_struct sizes based on contention.380clare # [ 0.009565] 2G module region forced by RANDOMIZE_MODULE_REGION_FULL381bob # [ 0.000000] sched_clock: 56 bits at 25MHz, resolution 40ns, wraps every 4398046511100ns382bob # [ 0.000051] arm-pv: using stolen time PV383clare # [ 0.009570] 0 pages in range for non-PLT usage384alice # [ 0.000000] clocksource: jiffies: mask: 0xffffffff max_cycles: 0xffffffff, max_idle_ns: 7645041785100000 ns385clare # [ 0.009571] 508192 pages in range for PLT usage386alice # [ 0.000000] arch_timer: Enabling local workaround for ARM erratum 1418040387bob # [ 0.000366] kfence: initialized - using 2097152 bytes for 255 objects at 0x(____ptrval____)-0x(____ptrval____)388clare # [ 0.009660] pinctrl core: initialized pinctrl subsystem389alice # [ 0.000000] arch_timer: cp15 timer running at 25.00MHz (virt).390clare # [ 0.010503] DMI not present or invalid.391bob # [ 0.000684] Console: colour dummy device 80x25392bob # [ 0.000697] printk: legacy console [tty0] enabled393clare # [ 0.013788] NET: Registered PF_NETLINK/PF_ROUTE protocol family394alice # [ 0.000000] clocksource: arch_sys_counter: mask: 0xffffffffffffff max_cycles: 0x5c40939b5, max_idle_ns: 440795202646 ns395clare # [ 0.016459] DMA: preallocated 128 KiB GFP_KERNEL pool for atomic allocations396bob # [ 0.000919] Calibrating delay loop (skipped), value calculated using timer frequency.. 50.00 BogoMIPS (lpj=100000)397alice # [ 0.000000] sched_clock: 56 bits at 25MHz, resolution 40ns, wraps every 4398046511100ns398bob # [ 0.000924] pid_max: default: 32768 minimum: 301399clare # [ 0.016589] DMA: preallocated 128 KiB GFP_KERNEL|GFP_DMA pool for atomic allocations400alice # [ 0.000054] arm-pv: using stolen time PV401bob # [ 0.000998] LSM: initializing lsm=capability,landlock,yama,bpf,ima402clare # [ 0.016736] DMA: preallocated 128 KiB GFP_KERNEL|GFP_DMA32 pool for atomic allocations403bob # [ 0.001147] landlock: Up and running.404alice # [ 0.000384] kfence: initialized - using 2097152 bytes for 255 objects at 0x(____ptrval____)-0x(____ptrval____)405clare # [ 0.016752] audit: initializing netlink subsys (disabled)406bob # [ 0.001149] Yama: becoming mindful.407alice # [ 0.000677] Console: colour dummy device 80x25408bob # [ 0.001535] LSM support for eBPF active409clare # [ 0.017330] thermal_sys: Registered thermal governor 'fair_share'410alice # [ 0.000688] printk: legacy console [tty0] enabled411bob # [ 0.001680] Mount-cache hash table entries: 2048 (order: 2, 16384 bytes, linear)412clare # [ 0.017333] thermal_sys: Registered thermal governor 'bang_bang'413alice # [ 0.000923] Calibrating delay loop (skipped), value calculated using timer frequency.. 50.00 BogoMIPS (lpj=100000)414clare # [ 0.017336] thermal_sys: Registered thermal governor 'step_wise'415bob # [ 0.001704] Mountpoint-cache hash table entries: 2048 (order: 2, 16384 bytes, linear)416alice # [ 0.000928] pid_max: default: 32768 minimum: 301417clare # [ 0.017338] thermal_sys: Registered thermal governor 'user_space'418bob # [ 0.004427] rcu: Hierarchical SRCU implementation.419alice # [ 0.001031] LSM: initializing lsm=capability,landlock,yama,bpf,ima420bob # [ 0.004433] rcu: Max phase no-delay instances is 1000.421clare # [ 0.017340] thermal_sys: Registered thermal governor 'power_allocator'422alice # [ 0.001166] landlock: Up and running.423bob # [ 0.005406] fsl-mc MSI: its@8080000 domain created424alice # [ 0.001168] Yama: becoming mindful.425bob # [ 0.005599] EFI services will not be available.426clare # [ 0.017377] audit: type=2000 audit(0.016:1): state=initialized audit_enabled=0 res=1427alice # [ 0.001579] LSM support for eBPF active428clare # [ 0.017386] cpuidle: using governor ladder429bob # [ 0.005686] smp: Bringing up secondary CPUs ...430clare # [ 0.017390] cpuidle: using governor menu431alice # [ 0.001754] Mount-cache hash table entries: 2048 (order: 2, 16384 bytes, linear)432bob # [ 0.005722] smp: Brought up 1 node, 1 CPU433bob # [ 0.005727] SMP: Total of 1 processors activated.434clare # [ 0.017506] hw-breakpoint: found 6 breakpoint and 4 watchpoint registers.435alice # [ 0.001773] Mountpoint-cache hash table entries: 2048 (order: 2, 16384 bytes, linear)436bob # [ 0.005729] CPU: All CPU(s) started at EL1437clare # [ 0.017527] ASID allocator initialised with 32768 entries438alice # [ 0.004463] rcu: Hierarchical SRCU implementation.439bob # [ 0.005742] CPU features: detected: 32-bit EL0 Support440clare # [ 0.018172] Serial: AMBA PL011 UART driver441alice # [ 0.004470] rcu: Max phase no-delay instances is 1000.442alice # [ 0.005408] fsl-mc MSI: its@8080000 domain created443bob # [ 0.005745] CPU features: detected: Data cache clean to the PoU not required for I/D coherence444clare # [ 0.021744] 9000000.pl011: ttyAMA0 at MMIO 0x9000000 (irq = 13, base_baud = 0) is a PL011 rev1445alice # [ 0.005610] EFI services will not be available.446clare # [ 0.021891] printk: console [ttyAMA0] enabled447bob # [ 0.005748] CPU features: detected: Common not Private translations448alice # [ 0.005709] smp: Bringing up secondary CPUs ...449bob # [ 0.005750] CPU features: detected: CRC32 instructions450alice # [ 0.005738] smp: Brought up 1 node, 1 CPU451alice # [ 0.005743] SMP: Total of 1 processors activated.452bob # [ 0.005752] CPU features: detected: Data cache clean to Point of Persistence453alice # [ 0.005744] CPU: All CPU(s) started at EL1454bob # [ 0.005755] CPU features: detected: Enhanced Virtualization Traps455alice # [ 0.005756] CPU features: detected: 32-bit EL0 Support456bob # [ 0.005765] CPU features: detected: RCpc load-acquire (LDAPR)457alice # [ 0.005759] CPU features: detected: Data cache clean to the PoU not required for I/D coherence458bob # [ 0.005767] CPU features: detected: LSE atomic instructions459bob # [ 0.005769] CPU features: detected: Privileged Access Never460alice # [ 0.005762] CPU features: detected: Common not Private translations461bob # [ 0.005771] CPU features: detected: PMUv3462alice # [ 0.005764] CPU features: detected: CRC32 instructions463bob # [ 0.005772] CPU features: detected: RAS Extension Support464alice # [ 0.005766] CPU features: detected: Data cache clean to Point of Persistence465bob # [ 0.005776] CPU features: detected: Speculative Store Bypassing Safe (SSBS)466alice # [ 0.005769] CPU features: detected: Enhanced Virtualization Traps467bob # [ 0.005796] alternatives: applying system-wide alternatives468alice # [ 0.005778] CPU features: detected: RCpc load-acquire (LDAPR)469bob # [ 0.007220] CPU features: detected: Hardware dirty bit management on CPU0470alice # [ 0.005781] CPU features: detected: LSE atomic instructions471alice # [ 0.005783] CPU features: detected: Privileged Access Never472alice # [ 0.005785] CPU features: detected: PMUv3473bob # [ 0.007419] Memory: 891124K/1048576K available (24576K kernel code, 7094K rwdata, 26568K rodata, 4736K init, 1106K bss, 116112K reserved, 32768K cma-reserved)474bob # [ 0.007875] devtmpfs: initialized475alice # [ 0.005787] CPU features: detected: RAS Extension Support476bob # [ 0.009592] posixtimers hash table entries: 512 (order: 1, 8192 bytes, linear)477alice # [ 0.005790] CPU features: detected: Speculative Store Bypassing Safe (SSBS)478alice # [ 0.005810] alternatives: applying system-wide alternatives479bob # [ 0.009616] futex hash table entries: 256 (16384 bytes on 1 NUMA nodes, total 16 KiB, linear).480alice # [ 0.007344] CPU features: detected: Hardware dirty bit management on CPU0481bob # [ 0.009743] 2G module region forced by RANDOMIZE_MODULE_REGION_FULL482bob # [ 0.009748] 0 pages in range for non-PLT usage483bob # [ 0.009749] 508192 pages in range for PLT usage484alice # [ 0.007567] Memory: 891144K/1048576K available (24576K kernel code, 7094K rwdata, 26568K rodata, 4736K init, 1106K bss, 116128K reserved, 32768K cma-reserved)485bob # [ 0.009854] pinctrl core: initialized pinctrl subsystem486alice # [ 0.008033] devtmpfs: initialized487bob # [ 0.010627] DMI not present or invalid.488alice # [ 0.009565] posixtimers hash table entries: 512 (order: 1, 8192 bytes, linear)489bob # [ 0.013983] NET: Registered PF_NETLINK/PF_ROUTE protocol family490clare # [ 0.093523] HugeTLB: registered 1.00 GiB page size, pre-allocated 0 pages491bob # [ 0.016467] DMA: preallocated 128 KiB GFP_KERNEL pool for atomic allocations492alice # [ 0.009589] futex hash table entries: 256 (16384 bytes on 1 NUMA nodes, total 16 KiB, linear).493clare # [ 0.093536] HugeTLB: 0 KiB vmemmap can be freed for a 1.00 GiB page494alice # [ 0.009707] 2G module region forced by RANDOMIZE_MODULE_REGION_FULL495bob # [ 0.016600] DMA: preallocated 128 KiB GFP_KERNEL|GFP_DMA pool for atomic allocations496clare # [ 0.093538] HugeTLB: registered 32.0 MiB page size, pre-allocated 0 pages497alice # [ 0.009713] 0 pages in range for non-PLT usage498bob # [ 0.016752] DMA: preallocated 128 KiB GFP_KERNEL|GFP_DMA32 pool for atomic allocations499alice # [ 0.009713] 508192 pages in range for PLT usage500clare # [ 0.093542] HugeTLB: 0 KiB vmemmap can be freed for a 32.0 MiB page501bob # [ 0.016768] audit: initializing netlink subsys (disabled)502alice # [ 0.009817] pinctrl core: initialized pinctrl subsystem503clare # [ 0.093545] HugeTLB: registered 2.00 MiB page size, pre-allocated 0 pages504alice # [ 0.010568] DMI not present or invalid.505bob # [ 0.017333] thermal_sys: Registered thermal governor 'fair_share'506clare # [ 0.093546] HugeTLB: 0 KiB vmemmap can be freed for a 2.00 MiB page507alice # [ 0.014118] NET: Registered PF_NETLINK/PF_ROUTE protocol family508bob # [ 0.017336] thermal_sys: Registered thermal governor 'bang_bang'509clare # [ 0.093548] HugeTLB: registered 64.0 KiB page size, pre-allocated 0 pages510alice # [ 0.016597] DMA: preallocated 128 KiB GFP_KERNEL pool for atomic allocations511bob # [ 0.017339] thermal_sys: Registered thermal governor 'step_wise'512clare # [ 0.093550] HugeTLB: 0 KiB vmemmap can be freed for a 64.0 KiB page513bob # [ 0.017341] thermal_sys: Registered thermal governor 'user_space'514alice # [ 0.016726] DMA: preallocated 128 KiB GFP_KERNEL|GFP_DMA pool for atomic allocations515clare # [ 0.094551] fbcon: Taking over console516clare # [ 0.094561] ACPI: Interpreter disabled.517bob # [ 0.017343] thermal_sys: Registered thermal governor 'power_allocator'518alice # [ 0.016873] DMA: preallocated 128 KiB GFP_KERNEL|GFP_DMA32 pool for atomic allocations519clare # [ 0.097210] iommu: Default domain type: Translated520alice # [ 0.016889] audit: initializing netlink subsys (disabled)521bob # [ 0.017381] audit: type=2000 audit(0.016:1): state=initialized audit_enabled=0 res=1522clare # [ 0.097215] iommu: DMA domain TLB invalidation policy: strict mode523bob # [ 0.017390] cpuidle: using governor ladder524clare # [ 0.097516] SCSI subsystem initialized525alice # [ 0.017426] thermal_sys: Registered thermal governor 'fair_share'526bob # [ 0.017395] cpuidle: using governor menu527alice # [ 0.017429] thermal_sys: Registered thermal governor 'bang_bang'528bob # [ 0.017509] hw-breakpoint: found 6 breakpoint and 4 watchpoint registers.529alice # [ 0.017432] thermal_sys: Registered thermal governor 'step_wise'530bob # [ 0.017529] ASID allocator initialised with 32768 entries531alice # [ 0.017434] thermal_sys: Registered thermal governor 'user_space'532bob # [ 0.018197] Serial: AMBA PL011 UART driver533alice # [ 0.017435] thermal_sys: Registered thermal governor 'power_allocator'534bob # [ 0.021712] 9000000.pl011: ttyAMA0 at MMIO 0x9000000 (irq = 13, base_baud = 0) is a PL011 rev1535bob # [ 0.021852] printk: console [ttyAMA0] enabled536alice # [ 0.017475] audit: type=2000 audit(0.016:1): state=initialized audit_enabled=0 res=1537clare # [ 0.103394] usbcore: registered new interface driver usbfs538alice # [ 0.017484] cpuidle: using governor ladder539alice # [ 0.017489] cpuidle: using governor menu540clare # [ 0.103431] usbcore: registered new interface driver hub541clare # [ 0.103441] usbcore: registered new device driver usb542alice # [ 0.017604] hw-breakpoint: found 6 breakpoint and 4 watchpoint registers.543clare # [ 0.103662] pps_core: LinuxPPS API ver. 1 registered544alice # [ 0.017624] ASID allocator initialised with 32768 entries545alice # [ 0.018291] Serial: AMBA PL011 UART driver546clare # [ 0.103665] pps_core: Software ver. 5.3.6 - Copyright 2005-2007 Rodolfo Giometti <giometti@linux.it>547clare # [ 0.103670] PTP clock support registered548alice # [ 0.021773] 9000000.pl011: ttyAMA0 at MMIO 0x9000000 (irq = 13, base_baud = 0) is a PL011 rev1549clare # [ 0.103702] EDAC MC: Ver: 3.0.0550alice # [ 0.021965] printk: console [ttyAMA0] enabled551clare # [ 0.103862] scmi_core: SCMI protocol bus registered552clare # [ 0.104136] FPGA manager framework553clare # [ 0.108990] vgaarb: loaded554clare # [ 0.109204] clocksource: Switched to clocksource arch_sys_counter555bob # [ 0.093549] HugeTLB: registered 1.00 GiB page size, pre-allocated 0 pages556bob # [ 0.093563] HugeTLB: 0 KiB vmemmap can be freed for a 1.00 GiB page557bob # [ 0.093566] HugeTLB: registered 32.0 MiB page size, pre-allocated 0 pages558bob # [ 0.093570] HugeTLB: 0 KiB vmemmap can be freed for a 32.0 MiB page559bob # [ 0.093572] HugeTLB: registered 2.00 MiB page size, pre-allocated 0 pages560bob # [ 0.093574] HugeTLB: 0 KiB vmemmap can be freed for a 2.00 MiB page561bob # [ 0.093576] HugeTLB: registered 64.0 KiB page size, pre-allocated 0 pages562bob # [ 0.093578] HugeTLB: 0 KiB vmemmap can be freed for a 64.0 KiB page563bob # [ 0.094560] fbcon: Taking over console564alice # [ 0.094888] HugeTLB: registered 1.00 GiB page size, pre-allocated 0 pages565bob # [ 0.094570] ACPI: Interpreter disabled.566bob # [ 0.097222] iommu: Default domain type: Translated567alice # [ 0.094902] HugeTLB: 0 KiB vmemmap can be freed for a 1.00 GiB page568bob # [ 0.097227] iommu: DMA domain TLB invalidation policy: strict mode569alice # [ 0.094905] HugeTLB: registered 32.0 MiB page size, pre-allocated 0 pages570bob # [ 0.097551] SCSI subsystem initialized571alice # [ 0.094909] HugeTLB: 0 KiB vmemmap can be freed for a 32.0 MiB page572alice # [ 0.094911] HugeTLB: registered 2.00 MiB page size, pre-allocated 0 pages573alice # [ 0.094913] HugeTLB: 0 KiB vmemmap can be freed for a 2.00 MiB page574alice # [ 0.094915] HugeTLB: registered 64.0 KiB page size, pre-allocated 0 pages575alice # [ 0.094917] HugeTLB: 0 KiB vmemmap can be freed for a 64.0 KiB page576bob # [ 0.103612] usbcore: registered new interface driver usbfs577alice # [ 0.095935] fbcon: Taking over console578alice # [ 0.095945] ACPI: Interpreter disabled.579bob # [ 0.103644] usbcore: registered new interface driver hub580alice # [ 0.096610] iommu: Default domain type: Translated581bob # [ 0.103655] usbcore: registered new device driver usb582alice # [ 0.096614] iommu: DMA domain TLB invalidation policy: strict mode583bob # [ 0.103870] pps_core: LinuxPPS API ver. 1 registered584alice # [ 0.096905] SCSI subsystem initialized585clare # [ 0.122492] VFS: Disk quotas dquot_6.6.0586bob # [ 0.103874] pps_core: Software ver. 5.3.6 - Copyright 2005-2007 Rodolfo Giometti <giometti@linux.it>587alice # [ 0.098713] usbcore: registered new interface driver usbfs588clare # [ 0.122517] VFS: Dquot-cache hash table entries: 512 (order 0, 4096 bytes)589bob # [ 0.103878] PTP clock support registered590alice # [ 0.098746] usbcore: registered new interface driver hub591clare # [ 0.123972] netfs: FS-Cache loaded592bob # [ 0.103911] EDAC MC: Ver: 3.0.0593clare # [ 0.124079] pnp: PnP ACPI: disabled594alice # [ 0.098756] usbcore: registered new device driver usb595bob # [ 0.104077] scmi_core: SCMI protocol bus registered596alice # [ 0.098998] pps_core: LinuxPPS API ver. 1 registered597bob # [ 0.104370] FPGA manager framework598alice # [ 0.099002] pps_core: Software ver. 5.3.6 - Copyright 2005-2007 Rodolfo Giometti <giometti@linux.it>599bob # [ 0.109155] vgaarb: loaded600alice # [ 0.099006] PTP clock support registered601bob # [ 0.109382] clocksource: Switched to clocksource arch_sys_counter602alice # [ 0.099042] EDAC MC: Ver: 3.0.0603clare # [ 0.127299] NET: Registered PF_INET protocol family604clare # [ 0.127469] IP idents hash table entries: 16384 (order: 5, 131072 bytes, linear)605alice # [ 0.108080] scmi_core: SCMI protocol bus registered606alice # [ 0.108408] FPGA manager framework607alice # [ 0.112133] vgaarb: loaded608alice # [ 0.112344] clocksource: Switched to clocksource arch_sys_counter609bob # [ 0.122598] VFS: Disk quotas dquot_6.6.0610bob # [ 0.122625] VFS: Dquot-cache hash table entries: 512 (order 0, 4096 bytes)611bob # [ 0.124063] netfs: FS-Cache loaded612bob # [ 0.124174] pnp: PnP ACPI: disabled613alice # [ 0.123048] VFS: Disk quotas dquot_6.6.0614alice # [ 0.123075] VFS: Dquot-cache hash table entries: 512 (order 0, 4096 bytes)615bob # [ 0.127466] NET: Registered PF_INET protocol family616bob # [ 0.127646] IP idents hash table entries: 16384 (order: 5, 131072 bytes, linear)617alice # [ 0.125414] netfs: FS-Cache loaded618alice # [ 0.125541] pnp: PnP ACPI: disabled619alice # [ 0.127385] NET: Registered PF_INET protocol family620alice # [ 0.127566] IP idents hash table entries: 16384 (order: 5, 131072 bytes, linear)621clare # [ 0.151835] tcp_listen_portaddr_hash hash table entries: 512 (order: 1, 8192 bytes, linear)622clare # [ 0.151853] Table-perturb hash table entries: 65536 (order: 6, 262144 bytes, linear)623clare # [ 0.151864] TCP established hash table entries: 8192 (order: 4, 65536 bytes, linear)624clare # [ 0.151901] TCP bind hash table entries: 8192 (order: 6, 262144 bytes, linear)625clare # [ 0.151967] TCP: Hash tables configured (established 8192 bind 8192)626clare # [ 0.152059] MPTCP token hash table entries: 1024 (order: 3, 24576 bytes, linear)627clare # [ 0.152115] UDP hash table entries: 512 (order: 3, 32768 bytes, linear)628clare # [ 0.152170] UDP-Lite hash table entries: 512 (order: 3, 32768 bytes, linear)629clare # [ 0.152281] NET: Registered PF_UNIX/PF_LOCAL protocol family630clare # [ 0.152309] NET: Registered PF_XDP protocol family631clare # [ 0.152329] PCI: CLS 0 bytes, default 64632clare # [ 0.152526] Trying to unpack rootfs image as initramfs...633clare # [ 0.165227] kvm [1]: HYP mode not available634alice # [ 0.152714] tcp_listen_portaddr_hash hash table entries: 512 (order: 1, 8192 bytes, linear)635alice # [ 0.152736] Table-perturb hash table entries: 65536 (order: 6, 262144 bytes, linear)636alice # [ 0.152748] TCP established hash table entries: 8192 (order: 4, 65536 bytes, linear)637alice # [ 0.152783] TCP bind hash table entries: 8192 (order: 6, 262144 bytes, linear)638alice # [ 0.152850] TCP: Hash tables configured (established 8192 bind 8192)639bob # [ 0.152213] tcp_listen_portaddr_hash hash table entries: 512 (order: 1, 8192 bytes, linear)640alice # [ 0.152948] MPTCP token hash table entries: 1024 (order: 3, 24576 bytes, linear)641bob # [ 0.152237] Table-perturb hash table entries: 65536 (order: 6, 262144 bytes, linear)642alice # [ 0.152974] UDP hash table entries: 512 (order: 3, 32768 bytes, linear)643bob # [ 0.152248] TCP established hash table entries: 8192 (order: 4, 65536 bytes, linear)644alice # [ 0.153029] UDP-Lite hash table entries: 512 (order: 3, 32768 bytes, linear)645bob # [ 0.152285] TCP bind hash table entries: 8192 (order: 6, 262144 bytes, linear)646alice # [ 0.153135] NET: Registered PF_UNIX/PF_LOCAL protocol family647bob # [ 0.152364] TCP: Hash tables configured (established 8192 bind 8192)648alice # [ 0.153162] NET: Registered PF_XDP protocol family649alice # [ 0.153183] PCI: CLS 0 bytes, default 64650bob # [ 0.152476] MPTCP token hash table entries: 1024 (order: 3, 24576 bytes, linear)651alice # [ 0.153468] Trying to unpack rootfs image as initramfs...652bob # [ 0.152530] UDP hash table entries: 512 (order: 3, 32768 bytes, linear)653bob # [ 0.152586] UDP-Lite hash table entries: 512 (order: 3, 32768 bytes, linear)654bob # [ 0.152711] NET: Registered PF_UNIX/PF_LOCAL protocol family655bob # [ 0.152745] NET: Registered PF_XDP protocol family656bob # [ 0.152767] PCI: CLS 0 bytes, default 64657alice # [ 0.162720] kvm [1]: HYP mode not available658bob # [ 0.152973] Trying to unpack rootfs image as initramfs...659bob # [ 0.167616] kvm [1]: HYP mode not available660clare # [ 0.229664] Initialise system trusted keyrings661clare # [ 0.229791] workingset: timestamp_bits=42 max_order=18 bucket_order=0662clare # [ 0.230106] squashfs: version 4.0 (2009/01/31) Phillip Lougher663clare # [ 0.230150] 9p: Installing v9fs 9p2000 file system support664bob # [ 0.229825] Initialise system trusted keyrings665bob # [ 0.229947] workingset: timestamp_bits=42 max_order=18 bucket_order=0666bob # [ 0.230293] squashfs: version 4.0 (2009/01/31) Phillip Lougher667bob # [ 0.230333] 9p: Installing v9fs 9p2000 file system support668alice # [ 0.232756] Initialise system trusted keyrings669alice # [ 0.232912] workingset: timestamp_bits=42 max_order=18 bucket_order=0670alice # [ 0.233231] squashfs: version 4.0 (2009/01/31) Phillip Lougher671alice # [ 0.233276] 9p: Installing v9fs 9p2000 file system support672clare # [ 0.258742] Key type asymmetric registered673clare # [ 0.258758] Asymmetric key parser 'x509' registered674clare # [ 0.258822] Block layer SCSI generic (bsg) driver version 0.4 loaded (major 242)675clare # [ 0.258923] io scheduler mq-deadline registered676clare # [ 0.258927] io scheduler kyber registered677clare # [ 0.263153] pl061_gpio 9030000.pl061: PL061 GPIO chip registered678clare # [ 0.263510] ledtrig-cpu: registered to indicate activity on CPUs679clare # [ 0.263808] pci-host-generic 4010000000.pcie: host bridge /pcie@10000000 ranges:680clare # [ 0.263824] pci-host-generic 4010000000.pcie: IO 0x003eff0000..0x003effffff -> 0x0000000000681bob # [ 0.249145] Key type asymmetric registered682bob # [ 0.249161] Asymmetric key parser 'x509' registered683clare # [ 0.263849] pci-host-generic 4010000000.pcie: MEM 0x0010000000..0x003efeffff -> 0x0010000000684bob # [ 0.249225] Block layer SCSI generic (bsg) driver version 0.4 loaded (major 242)685clare # [ 0.263853] pci-host-generic 4010000000.pcie: MEM 0x8000000000..0xffffffffff -> 0x8000000000686clare # [ 0.263876] pci-host-generic 4010000000.pcie: Memory resource size exceeds max for 32 bits687clare # [ 0.263895] pci-host-generic 4010000000.pcie: ECAM at [mem 0x4010000000-0x401fffffff] for [bus 00-ff]688clare # [ 0.263962] pci-host-generic 4010000000.pcie: PCI host bridge to bus 0000:00689clare # [ 0.263982] pci_bus 0000:00: root bus resource [bus 00-ff]690clare # [ 0.263985] pci_bus 0000:00: root bus resource [io 0x0000-0xffff]691clare # [ 0.263988] pci_bus 0000:00: root bus resource [mem 0x10000000-0x3efeffff]692clare # [ 0.263990] pci_bus 0000:00: root bus resource [mem 0x8000000000-0xffffffffff]693clare # [ 0.264060] pci 0000:00:00.0: [1b36:0008] type 00 class 0x060000 conventional PCI endpoint694clare # [ 0.264520] pci 0000:00:01.0: [1af4:1000] type 00 class 0x020000 conventional PCI endpoint695clare # [ 0.264643] pci 0000:00:01.0: BAR 0 [io 0x0000-0x001f]696clare # [ 0.264653] pci 0000:00:01.0: BAR 1 [mem 0x00000000-0x00000fff]697clare # [ 0.264671] pci 0000:00:01.0: BAR 4 [mem 0x00000000-0x00003fff 64bit pref]698clare # [ 0.264679] pci 0000:00:01.0: ROM [mem 0x00000000-0x0003ffff pref]699clare # [ 0.264989] pci 0000:00:02.0: [1af4:1005] type 00 class 0x00ff00 conventional PCI endpoint700clare # [ 0.265112] pci 0000:00:02.0: BAR 0 [io 0x0000-0x001f]701clare # [ 0.265120] pci 0000:00:02.0: BAR 1 [mem 0x00000000-0x00000fff]702alice # [ 0.253888] Key type asymmetric registered703clare # [ 0.265138] pci 0000:00:02.0: BAR 4 [mem 0x00000000-0x00003fff 64bit pref]704alice # [ 0.253904] Asymmetric key parser 'x509' registered705alice # [ 0.253964] Block layer SCSI generic (bsg) driver version 0.4 loaded (major 242)706alice # [ 0.254056] io scheduler mq-deadline registered707alice # [ 0.254059] io scheduler kyber registered708bob # [ 0.257434] io scheduler mq-deadline registered709bob # [ 0.257442] io scheduler kyber registered710bob # [ 0.259776] pl061_gpio 9030000.pl061: PL061 GPIO chip registered711bob # [ 0.262564] ledtrig-cpu: registered to indicate activity on CPUs712bob # [ 0.262930] pci-host-generic 4010000000.pcie: host bridge /pcie@10000000 ranges:713bob # [ 0.262948] pci-host-generic 4010000000.pcie: IO 0x003eff0000..0x003effffff -> 0x0000000000714bob # [ 0.262969] pci-host-generic 4010000000.pcie: MEM 0x0010000000..0x003efeffff -> 0x0010000000715bob # [ 0.262973] pci-host-generic 4010000000.pcie: MEM 0x8000000000..0xffffffffff -> 0x8000000000716bob # [ 0.263001] pci-host-generic 4010000000.pcie: Memory resource size exceeds max for 32 bits717bob # [ 0.263021] pci-host-generic 4010000000.pcie: ECAM at [mem 0x4010000000-0x401fffffff] for [bus 00-ff]718bob # [ 0.263099] pci-host-generic 4010000000.pcie: PCI host bridge to bus 0000:00719bob # [ 0.263119] pci_bus 0000:00: root bus resource [bus 00-ff]720alice # [ 0.264471] pl061_gpio 9030000.pl061: PL061 GPIO chip registered721bob # [ 0.263122] pci_bus 0000:00: root bus resource [io 0x0000-0xffff]722alice # [ 0.264836] ledtrig-cpu: registered to indicate activity on CPUs723bob # [ 0.263125] pci_bus 0000:00: root bus resource [mem 0x10000000-0x3efeffff]724clare # [ 0.285552] pci 0000:00:03.0: [1af4:1001] type 00 class 0x010000 conventional PCI endpoint725alice # [ 0.265148] pci-host-generic 4010000000.pcie: host bridge /pcie@10000000 ranges:726clare # [ 0.285682] pci 0000:00:03.0: BAR 0 [io 0x0000-0x007f]727bob # [ 0.263127] pci_bus 0000:00: root bus resource [mem 0x8000000000-0xffffffffff]728clare # [ 0.285692] pci 0000:00:03.0: BAR 1 [mem 0x00000000-0x00000fff]729alice # [ 0.265165] pci-host-generic 4010000000.pcie: IO 0x003eff0000..0x003effffff -> 0x0000000000730bob # [ 0.263198] pci 0000:00:00.0: [1b36:0008] type 00 class 0x060000 conventional PCI endpoint731clare # [ 0.285711] pci 0000:00:03.0: BAR 4 [mem 0x00000000-0x00003fff 64bit pref]732alice # [ 0.265177] pci-host-generic 4010000000.pcie: MEM 0x0010000000..0x003efeffff -> 0x0010000000733bob # [ 0.263657] pci 0000:00:01.0: [1af4:1000] type 00 class 0x020000 conventional PCI endpoint734clare # [ 0.286029] pci 0000:00:04.0: [1af4:1000] type 00 class 0x020000 conventional PCI endpoint735bob # [ 0.263782] pci 0000:00:01.0: BAR 0 [io 0x0000-0x001f]736alice # [ 0.265182] pci-host-generic 4010000000.pcie: MEM 0x8000000000..0xffffffffff -> 0x8000000000737clare # [ 0.286155] pci 0000:00:04.0: BAR 0 [io 0x0000-0x001f]738bob # [ 0.263791] pci 0000:00:01.0: BAR 1 [mem 0x00000000-0x00000fff]739clare # [ 0.286164] pci 0000:00:04.0: BAR 1 [mem 0x00000000-0x00000fff]740alice # [ 0.265208] pci-host-generic 4010000000.pcie: Memory resource size exceeds max for 32 bits741bob # [ 0.263810] pci 0000:00:01.0: BAR 4 [mem 0x00000000-0x00003fff 64bit pref]742clare # [ 0.286182] pci 0000:00:04.0: BAR 4 [mem 0x00000000-0x00003fff 64bit pref]743bob # [ 0.263818] pci 0000:00:01.0: ROM [mem 0x00000000-0x0003ffff pref]744alice # [ 0.265230] pci-host-generic 4010000000.pcie: ECAM at [mem 0x4010000000-0x401fffffff] for [bus 00-ff]745clare # [ 0.286190] pci 0000:00:04.0: ROM [mem 0x00000000-0x0003ffff pref]746alice # [ 0.265297] pci-host-generic 4010000000.pcie: PCI host bridge to bus 0000:00747bob # [ 0.264137] pci 0000:00:02.0: [1af4:1005] type 00 class 0x00ff00 conventional PCI endpoint748clare # [ 0.286536] pci 0000:00:05.0: [1af4:1050] type 00 class 0x038000 conventional PCI endpoint749alice # [ 0.265318] pci_bus 0000:00: root bus resource [bus 00-ff]750bob # [ 0.264262] pci 0000:00:02.0: BAR 0 [io 0x0000-0x001f]751clare # [ 0.286664] pci 0000:00:05.0: BAR 1 [mem 0x00000000-0x00000fff]752bob # [ 0.264270] pci 0000:00:02.0: BAR 1 [mem 0x00000000-0x00000fff]753alice # [ 0.265322] pci_bus 0000:00: root bus resource [io 0x0000-0xffff]754clare # [ 0.286682] pci 0000:00:05.0: BAR 4 [mem 0x00000000-0x00003fff 64bit pref]755alice # [ 0.265324] pci_bus 0000:00: root bus resource [mem 0x10000000-0x3efeffff]756bob # [ 0.264288] pci 0000:00:02.0: BAR 4 [mem 0x00000000-0x00003fff 64bit pref]757clare # [ 0.287004] pci 0000:00:06.0: [1af4:1052] type 00 class 0x090000 conventional PCI endpoint758alice # [ 0.265327] pci_bus 0000:00: root bus resource [mem 0x8000000000-0xffffffffff]759bob # [ 0.264621] pci 0000:00:03.0: [1af4:1001] type 00 class 0x010000 conventional PCI endpoint760clare # [ 0.287131] pci 0000:00:06.0: BAR 1 [mem 0x00000000-0x00000fff]761bob # [ 0.264744] pci 0000:00:03.0: BAR 0 [io 0x0000-0x007f]762alice # [ 0.265402] pci 0000:00:00.0: [1b36:0008] type 00 class 0x060000 conventional PCI endpoint763clare # [ 0.287149] pci 0000:00:06.0: BAR 4 [mem 0x00000000-0x00003fff 64bit pref]764bob # [ 0.264753] pci 0000:00:03.0: BAR 1 [mem 0x00000000-0x00000fff]765alice # [ 0.265876] pci 0000:00:01.0: [1af4:1000] type 00 class 0x020000 conventional PCI endpoint766bob # [ 0.264771] pci 0000:00:03.0: BAR 4 [mem 0x00000000-0x00003fff 64bit pref]767clare # [ 0.287421] pci 0000:00:07.0: [8086:24cd] type 00 class 0x0c0320 conventional PCI endpoint768alice # [ 0.266004] pci 0000:00:01.0: BAR 0 [io 0x0000-0x001f]769clare # [ 0.287545] pci 0000:00:07.0: BAR 0 [mem 0x00000000-0x00000fff]770bob # [ 0.265081] pci 0000:00:04.0: [1af4:1000] type 00 class 0x020000 conventional PCI endpoint771alice # [ 0.266014] pci 0000:00:01.0: BAR 1 [mem 0x00000000-0x00000fff]772bob # [ 0.265205] pci 0000:00:04.0: BAR 0 [io 0x0000-0x001f]773clare # [ 0.287734] pci 0000:00:08.0: [1af4:105a] type 00 class 0x018000 conventional PCI endpoint774alice # [ 0.266033] pci 0000:00:01.0: BAR 4 [mem 0x00000000-0x00003fff 64bit pref]775bob # [ 0.265213] pci 0000:00:04.0: BAR 1 [mem 0x00000000-0x00000fff]776clare # [ 0.287860] pci 0000:00:08.0: BAR 1 [mem 0x00000000-0x00000fff]777alice # [ 0.266042] pci 0000:00:01.0: ROM [mem 0x00000000-0x0003ffff pref]778bob # [ 0.265231] pci 0000:00:04.0: BAR 4 [mem 0x00000000-0x00003fff 64bit pref]779clare # [ 0.287877] pci 0000:00:08.0: BAR 4 [mem 0x00000000-0x00003fff 64bit pref]780alice # [ 0.266375] pci 0000:00:02.0: [1af4:1005] type 00 class 0x00ff00 conventional PCI endpoint781bob # [ 0.265240] pci 0000:00:04.0: ROM [mem 0x00000000-0x0003ffff pref]782clare # [ 0.288188] pci 0000:00:09.0: [1af4:105a] type 00 class 0x018000 conventional PCI endpoint783alice # [ 0.266502] pci 0000:00:02.0: BAR 0 [io 0x0000-0x001f]784clare # [ 0.288318] pci 0000:00:09.0: BAR 1 [mem 0x00000000-0x00000fff]785alice # [ 0.266511] pci 0000:00:02.0: BAR 1 [mem 0x00000000-0x00000fff]786clare # [ 0.288336] pci 0000:00:09.0: BAR 4 [mem 0x00000000-0x00003fff 64bit pref]787alice # [ 0.266530] pci 0000:00:02.0: BAR 4 [mem 0x00000000-0x00003fff 64bit pref]788clare # [ 0.288644] pci 0000:00:0a.0: [1af4:105a] type 00 class 0x018000 conventional PCI endpoint789alice # [ 0.266849] pci 0000:00:03.0: [1af4:1001] type 00 class 0x010000 conventional PCI endpoint790clare # [ 0.288773] pci 0000:00:0a.0: BAR 1 [mem 0x00000000-0x00000fff]791alice # [ 0.266977] pci 0000:00:03.0: BAR 0 [io 0x0000-0x007f]792alice # [ 0.266987] pci 0000:00:03.0: BAR 1 [mem 0x00000000-0x00000fff]793clare # [ 0.288790] pci 0000:00:0a.0: BAR 4 [mem 0x00000000-0x00003fff 64bit pref]794alice # [ 0.267005] pci 0000:00:03.0: BAR 4 [mem 0x00000000-0x00003fff 64bit pref]795clare # [ 0.289115] pci 0000:00:0b.0: [1af4:1003] type 00 class 0x078000 conventional PCI endpoint796alice # [ 0.267328] pci 0000:00:04.0: [1af4:1000] type 00 class 0x020000 conventional PCI endpoint797alice # [ 0.267459] pci 0000:00:04.0: BAR 0 [io 0x0000-0x001f]798alice # [ 0.267469] pci 0000:00:04.0: BAR 1 [mem 0x00000000-0x00000fff]799alice # [ 0.267486] pci 0000:00:04.0: BAR 4 [mem 0x00000000-0x00003fff 64bit pref]800alice # [ 0.267495] pci 0000:00:04.0: ROM [mem 0x00000000-0x0003ffff pref]801clare # [ 0.303085] pci 0000:00:0b.0: BAR 0 [io 0x0000-0x003f]802clare # [ 0.303097] pci 0000:00:0b.0: BAR 1 [mem 0x00000000-0x00000fff]803alice # [ 0.267815] pci 0000:00:05.0: [1af4:1050] type 00 class 0x038000 conventional PCI endpoint804clare # [ 0.303115] pci 0000:00:0b.0: BAR 4 [mem 0x00000000-0x00003fff 64bit pref]805alice # [ 0.267944] pci 0000:00:05.0: BAR 1 [mem 0x00000000-0x00000fff]806alice # [ 0.267962] pci 0000:00:05.0: BAR 4 [mem 0x00000000-0x00003fff 64bit pref]807clare # [ 0.303462] pci 0000:00:0c.0: [1af4:1005] type 00 class 0x00ff00 conventional PCI endpoint808clare # [ 0.303588] pci 0000:00:0c.0: BAR 0 [io 0x0000-0x001f]809alice # [ 0.268289] pci 0000:00:06.0: [1af4:1052] type 00 class 0x090000 conventional PCI endpoint810clare # [ 0.303597] pci 0000:00:0c.0: BAR 1 [mem 0x00000000-0x00000fff]811clare # [ 0.303616] pci 0000:00:0c.0: BAR 4 [mem 0x00000000-0x00003fff 64bit pref]812clare # [ 0.304065] pci 0000:00:01.0: ROM [mem 0x10000000-0x1003ffff pref]: assigned813alice # [ 0.287475] pci 0000:00:06.0: BAR 1 [mem 0x00000000-0x00000fff]814clare # [ 0.304072] pci 0000:00:04.0: ROM [mem 0x10040000-0x1007ffff pref]: assigned815alice # [ 0.287496] pci 0000:00:06.0: BAR 4 [mem 0x00000000-0x00003fff 64bit pref]816alice # [ 0.287854] pci 0000:00:07.0: [8086:24cd] type 00 class 0x0c0320 conventional PCI endpoint817clare # [ 0.304075] pci 0000:00:01.0: BAR 4 [mem 0x8000000000-0x8000003fff 64bit pref]: assigned818alice # [ 0.287979] pci 0000:00:07.0: BAR 0 [mem 0x00000000-0x00000fff]819clare # [ 0.304108] pci 0000:00:02.0: BAR 4 [mem 0x8000004000-0x8000007fff 64bit pref]: assigned820alice # [ 0.288161] pci 0000:00:08.0: [1af4:105a] type 00 class 0x018000 conventional PCI endpoint821clare # [ 0.304138] pci 0000:00:03.0: BAR 4 [mem 0x8000008000-0x800000bfff 64bit pref]: assigned822alice # [ 0.288289] pci 0000:00:08.0: BAR 1 [mem 0x00000000-0x00000fff]823bob # [ 0.289653] pci 0000:00:05.0: [1af4:1050] type 00 class 0x038000 conventional PCI endpoint824clare # [ 0.304169] pci 0000:00:04.0: BAR 4 [mem 0x800000c000-0x800000ffff 64bit pref]: assigned825bob # [ 0.289792] pci 0000:00:05.0: BAR 1 [mem 0x00000000-0x00000fff]826alice # [ 0.288307] pci 0000:00:08.0: BAR 4 [mem 0x00000000-0x00003fff 64bit pref]827clare # [ 0.304200] pci 0000:00:05.0: BAR 4 [mem 0x8000010000-0x8000013fff 64bit pref]: assigned828bob # [ 0.289811] pci 0000:00:05.0: BAR 4 [mem 0x00000000-0x00003fff 64bit pref]829clare # [ 0.304229] pci 0000:00:06.0: BAR 4 [mem 0x8000014000-0x8000017fff 64bit pref]: assigned830alice # [ 0.292314] pci 0000:00:09.0: [1af4:105a] type 00 class 0x018000 conventional PCI endpoint831bob # [ 0.290141] pci 0000:00:06.0: [1af4:1052] type 00 class 0x090000 conventional PCI endpoint832bob # [ 0.290269] pci 0000:00:06.0: BAR 1 [mem 0x00000000-0x00000fff]833clare # [ 0.304259] pci 0000:00:08.0: BAR 4 [mem 0x8000018000-0x800001bfff 64bit pref]: assigned834bob # [ 0.290287] pci 0000:00:06.0: BAR 4 [mem 0x00000000-0x00003fff 64bit pref]835clare # [ 0.304288] pci 0000:00:09.0: BAR 4 [mem 0x800001c000-0x800001ffff 64bit pref]: assigned836bob # [ 0.290567] pci 0000:00:07.0: [8086:24cd] type 00 class 0x0c0320 conventional PCI endpoint837clare # [ 0.304318] pci 0000:00:0a.0: BAR 4 [mem 0x8000020000-0x8000023fff 64bit pref]: assigned838bob # [ 0.290692] pci 0000:00:07.0: BAR 0 [mem 0x00000000-0x00000fff]839clare # [ 0.304347] pci 0000:00:0b.0: BAR 4 [mem 0x8000024000-0x8000027fff 64bit pref]: assigned840bob # [ 0.290877] pci 0000:00:08.0: [1af4:105a] type 00 class 0x018000 conventional PCI endpoint841clare # [ 0.304406] pci 0000:00:0c.0: BAR 4 [mem 0x8000028000-0x800002bfff 64bit pref]: assigned842bob # [ 0.291006] pci 0000:00:08.0: BAR 1 [mem 0x00000000-0x00000fff]843clare # [ 0.304435] pci 0000:00:01.0: BAR 1 [mem 0x10080000-0x10080fff]: assigned844bob # [ 0.291023] pci 0000:00:08.0: BAR 4 [mem 0x00000000-0x00003fff 64bit pref]845clare # [ 0.304519] pci 0000:00:02.0: BAR 1 [mem 0x10081000-0x10081fff]: assigned846bob # [ 0.291342] pci 0000:00:09.0: [1af4:105a] type 00 class 0x018000 conventional PCI endpoint847clare # [ 0.304533] pci 0000:00:03.0: BAR 1 [mem 0x10082000-0x10082fff]: assigned848bob # [ 0.291472] pci 0000:00:09.0: BAR 1 [mem 0x00000000-0x00000fff]849clare # [ 0.304545] pci 0000:00:04.0: BAR 1 [mem 0x10083000-0x10083fff]: assigned850bob # [ 0.291490] pci 0000:00:09.0: BAR 4 [mem 0x00000000-0x00003fff 64bit pref]851clare # [ 0.304557] pci 0000:00:05.0: BAR 1 [mem 0x10084000-0x10084fff]: assigned852clare # [ 0.304569] pci 0000:00:06.0: BAR 1 [mem 0x10085000-0x10085fff]: assigned853bob # [ 0.291810] pci 0000:00:0a.0: [1af4:105a] type 00 class 0x018000 conventional PCI endpoint854bob # [ 0.291938] pci 0000:00:0a.0: BAR 1 [mem 0x00000000-0x00000fff]855clare # [ 0.304581] pci 0000:00:07.0: BAR 0 [mem 0x10086000-0x10086fff]: assigned856clare # [ 0.304593] pci 0000:00:08.0: BAR 1 [mem 0x10087000-0x10087fff]: assigned857bob # [ 0.291956] pci 0000:00:0a.0: BAR 4 [mem 0x00000000-0x00003fff 64bit pref]858clare # [ 0.304605] pci 0000:00:09.0: BAR 1 [mem 0x10088000-0x10088fff]: assigned859bob # [ 0.292278] pci 0000:00:0b.0: [1af4:1003] type 00 class 0x078000 conventional PCI endpoint860bob # [ 0.292456] pci 0000:00:0b.0: BAR 0 [io 0x0000-0x003f]861clare # [ 0.304617] pci 0000:00:0a.0: BAR 1 [mem 0x10089000-0x10089fff]: assigned862bob # [ 0.292466] pci 0000:00:0b.0: BAR 1 [mem 0x00000000-0x00000fff]863clare # [ 0.304629] pci 0000:00:0b.0: BAR 1 [mem 0x1008a000-0x1008afff]: assigned864bob # [ 0.292484] pci 0000:00:0b.0: BAR 4 [mem 0x00000000-0x00003fff 64bit pref]865clare # [ 0.304641] pci 0000:00:0c.0: BAR 1 [mem 0x1008b000-0x1008bfff]: assigned866clare # [ 0.304653] pci 0000:00:03.0: BAR 0 [io 0x1000-0x107f]: assigned867bob # [ 0.292888] pci 0000:00:0c.0: [1af4:1005] type 00 class 0x00ff00 conventional PCI endpoint868clare # [ 0.304664] pci 0000:00:0b.0: BAR 0 [io 0x1080-0x10bf]: assigned869bob # [ 0.293014] pci 0000:00:0c.0: BAR 0 [io 0x0000-0x001f]870clare # [ 0.304676] pci 0000:00:01.0: BAR 0 [io 0x10c0-0x10df]: assigned871bob # [ 0.293023] pci 0000:00:0c.0: BAR 1 [mem 0x00000000-0x00000fff]872clare # [ 0.304687] pci 0000:00:02.0: BAR 0 [io 0x10e0-0x10ff]: assigned873bob # [ 0.293041] pci 0000:00:0c.0: BAR 4 [mem 0x00000000-0x00003fff 64bit pref]874clare # [ 0.304699] pci 0000:00:04.0: BAR 0 [io 0x1100-0x111f]: assigned875clare # [ 0.304711] pci 0000:00:0c.0: BAR 0 [io 0x1120-0x113f]: assigned876alice # [ 0.300527] pci 0000:00:09.0: BAR 1 [mem 0x00000000-0x00000fff]877clare # [ 0.304728] pci_bus 0000:00: resource 4 [io 0x0000-0xffff]878alice # [ 0.300549] pci 0000:00:09.0: BAR 4 [mem 0x00000000-0x00003fff 64bit pref]879clare # [ 0.304732] pci_bus 0000:00: resource 5 [mem 0x10000000-0x3efeffff]880alice # [ 0.300891] pci 0000:00:0a.0: [1af4:105a] type 00 class 0x018000 conventional PCI endpoint881clare # [ 0.304739] pci_bus 0000:00: resource 6 [mem 0x8000000000-0xffffffffff]882alice # [ 0.301023] pci 0000:00:0a.0: BAR 1 [mem 0x00000000-0x00000fff]883alice # [ 0.301041] pci 0000:00:0a.0: BAR 4 [mem 0x00000000-0x00003fff 64bit pref]884bob # [ 0.306531] pci 0000:00:01.0: ROM [mem 0x10000000-0x1003ffff pref]: assigned885alice # [ 0.301369] pci 0000:00:0b.0: [1af4:1003] type 00 class 0x078000 conventional PCI endpoint886bob # [ 0.306538] pci 0000:00:04.0: ROM [mem 0x10040000-0x1007ffff pref]: assigned887alice # [ 0.301533] pci 0000:00:0b.0: BAR 0 [io 0x0000-0x003f]888alice # [ 0.301542] pci 0000:00:0b.0: BAR 1 [mem 0x00000000-0x00000fff]889bob # [ 0.306542] pci 0000:00:01.0: BAR 4 [mem 0x8000000000-0x8000003fff 64bit pref]: assigned890alice # [ 0.301613] pci 0000:00:0b.0: BAR 4 [mem 0x00000000-0x00003fff 64bit pref]891bob # [ 0.306577] pci 0000:00:02.0: BAR 4 [mem 0x8000004000-0x8000007fff 64bit pref]: assigned892clare # [ 0.326612] pci 0000:00:07.0: enabling device (0000 -> 0002)893alice # [ 0.301948] pci 0000:00:0c.0: [1af4:1005] type 00 class 0x00ff00 conventional PCI endpoint894bob # [ 0.306609] pci 0000:00:03.0: BAR 4 [mem 0x8000008000-0x800000bfff 64bit pref]: assigned895alice # [ 0.302076] pci 0000:00:0c.0: BAR 0 [io 0x0000-0x001f]896bob # [ 0.306640] pci 0000:00:04.0: BAR 4 [mem 0x800000c000-0x800000ffff 64bit pref]: assigned897alice # [ 0.302085] pci 0000:00:0c.0: BAR 1 [mem 0x00000000-0x00000fff]898alice # [ 0.302104] pci 0000:00:0c.0: BAR 4 [mem 0x00000000-0x00003fff 64bit pref]899bob # [ 0.306671] pci 0000:00:05.0: BAR 4 [mem 0x8000010000-0x8000013fff 64bit pref]: assigned900alice # [ 0.302544] pci 0000:00:01.0: ROM [mem 0x10000000-0x1003ffff pref]: assigned901bob # [ 0.306702] pci 0000:00:06.0: BAR 4 [mem 0x8000014000-0x8000017fff 64bit pref]: assigned902alice # [ 0.302551] pci 0000:00:04.0: ROM [mem 0x10040000-0x1007ffff pref]: assigned903bob # [ 0.306733] pci 0000:00:08.0: BAR 4 [mem 0x8000018000-0x800001bfff 64bit pref]: assigned904alice # [ 0.302554] pci 0000:00:01.0: BAR 4 [mem 0x8000000000-0x8000003fff 64bit pref]: assigned905bob # [ 0.306764] pci 0000:00:09.0: BAR 4 [mem 0x800001c000-0x800001ffff 64bit pref]: assigned906alice # [ 0.302589] pci 0000:00:02.0: BAR 4 [mem 0x8000004000-0x8000007fff 64bit pref]: assigned907bob # [ 0.306794] pci 0000:00:0a.0: BAR 4 [mem 0x8000020000-0x8000023fff 64bit pref]: assigned908alice # [ 0.302620] pci 0000:00:03.0: BAR 4 [mem 0x8000008000-0x800000bfff 64bit pref]: assigned909bob # [ 0.306825] pci 0000:00:0b.0: BAR 4 [mem 0x8000024000-0x8000027fff 64bit pref]: assigned910alice # [ 0.302652] pci 0000:00:04.0: BAR 4 [mem 0x800000c000-0x800000ffff 64bit pref]: assigned911bob # [ 0.306886] pci 0000:00:0c.0: BAR 4 [mem 0x8000028000-0x800002bfff 64bit pref]: assigned912alice # [ 0.302683] pci 0000:00:05.0: BAR 4 [mem 0x8000010000-0x8000013fff 64bit pref]: assigned913bob # [ 0.306916] pci 0000:00:01.0: BAR 1 [mem 0x10080000-0x10080fff]: assigned914alice # [ 0.302714] pci 0000:00:06.0: BAR 4 [mem 0x8000014000-0x8000017fff 64bit pref]: assigned915bob # [ 0.306957] pci 0000:00:02.0: BAR 1 [mem 0x10081000-0x10081fff]: assigned916bob # [ 0.306970] pci 0000:00:03.0: BAR 1 [mem 0x10082000-0x10082fff]: assigned917alice # [ 0.302746] pci 0000:00:08.0: BAR 4 [mem 0x8000018000-0x800001bfff 64bit pref]: assigned918bob # [ 0.306983] pci 0000:00:04.0: BAR 1 [mem 0x10083000-0x10083fff]: assigned919alice # [ 0.302777] pci 0000:00:09.0: BAR 4 [mem 0x800001c000-0x800001ffff 64bit pref]: assigned920bob # [ 0.306995] pci 0000:00:05.0: BAR 1 [mem 0x10084000-0x10084fff]: assigned921alice # [ 0.302807] pci 0000:00:0a.0: BAR 4 [mem 0x8000020000-0x8000023fff 64bit pref]: assigned922bob # [ 0.307007] pci 0000:00:06.0: BAR 1 [mem 0x10085000-0x10085fff]: assigned923alice # [ 0.302838] pci 0000:00:0b.0: BAR 4 [mem 0x8000024000-0x8000027fff 64bit pref]: assigned924bob # [ 0.307020] pci 0000:00:07.0: BAR 0 [mem 0x10086000-0x10086fff]: assigned925alice # [ 0.302920] pci 0000:00:0c.0: BAR 4 [mem 0x8000028000-0x800002bfff 64bit pref]: assigned926bob # [ 0.307032] pci 0000:00:08.0: BAR 1 [mem 0x10087000-0x10087fff]: assigned927alice # [ 0.302966] pci 0000:00:01.0: BAR 1 [mem 0x10080000-0x10080fff]: assigned928bob # [ 0.307044] pci 0000:00:09.0: BAR 1 [mem 0x10088000-0x10088fff]: assigned929alice # [ 0.302978] pci 0000:00:02.0: BAR 1 [mem 0x10081000-0x10081fff]: assigned930bob # [ 0.307056] pci 0000:00:0a.0: BAR 1 [mem 0x10089000-0x10089fff]: assigned931alice # [ 0.302990] pci 0000:00:03.0: BAR 1 [mem 0x10082000-0x10082fff]: assigned932bob # [ 0.307069] pci 0000:00:0b.0: BAR 1 [mem 0x1008a000-0x1008afff]: assigned933alice # [ 0.303002] pci 0000:00:04.0: BAR 1 [mem 0x10083000-0x10083fff]: assigned934bob # [ 0.307081] pci 0000:00:0c.0: BAR 1 [mem 0x1008b000-0x1008bfff]: assigned935alice # [ 0.303014] pci 0000:00:05.0: BAR 1 [mem 0x10084000-0x10084fff]: assigned936bob # [ 0.307093] pci 0000:00:03.0: BAR 0 [io 0x1000-0x107f]: assigned937alice # [ 0.303026] pci 0000:00:06.0: BAR 1 [mem 0x10085000-0x10085fff]: assigned938bob # [ 0.307105] pci 0000:00:0b.0: BAR 0 [io 0x1080-0x10bf]: assigned939bob # [ 0.307117] pci 0000:00:01.0: BAR 0 [io 0x10c0-0x10df]: assigned940alice # [ 0.303038] pci 0000:00:07.0: BAR 0 [mem 0x10086000-0x10086fff]: assigned941bob # [ 0.307129] pci 0000:00:02.0: BAR 0 [io 0x10e0-0x10ff]: assigned942alice # [ 0.303051] pci 0000:00:08.0: BAR 1 [mem 0x10087000-0x10087fff]: assigned943bob # [ 0.307141] pci 0000:00:04.0: BAR 0 [io 0x1100-0x111f]: assigned944alice # [ 0.303063] pci 0000:00:09.0: BAR 1 [mem 0x10088000-0x10088fff]: assigned945bob # [ 0.307153] pci 0000:00:0c.0: BAR 0 [io 0x1120-0x113f]: assigned946alice # [ 0.303075] pci 0000:00:0a.0: BAR 1 [mem 0x10089000-0x10089fff]: assigned947bob # [ 0.307169] pci_bus 0000:00: resource 4 [io 0x0000-0xffff]948alice # [ 0.303087] pci 0000:00:0b.0: BAR 1 [mem 0x1008a000-0x1008afff]: assigned949bob # [ 0.307173] pci_bus 0000:00: resource 5 [mem 0x10000000-0x3efeffff]950alice # [ 0.303099] pci 0000:00:0c.0: BAR 1 [mem 0x1008b000-0x1008bfff]: assigned951bob # [ 0.307182] pci_bus 0000:00: resource 6 [mem 0x8000000000-0xffffffffff]952clare # [ 0.341314] virtio-pci 0000:00:01.0: enabling device (0000 -> 0003)953alice # [ 0.303111] pci 0000:00:03.0: BAR 0 [io 0x1000-0x107f]: assigned954bob # [ 0.307736] pci 0000:00:07.0: enabling device (0000 -> 0002)955clare # [ 0.342915] virtio-pci 0000:00:02.0: enabling device (0000 -> 0003)956alice # [ 0.303122] pci 0000:00:0b.0: BAR 0 [io 0x1080-0x10bf]: assigned957clare # [ 0.344312] virtio-pci 0000:00:03.0: enabling device (0000 -> 0003)958alice # [ 0.303134] pci 0000:00:01.0: BAR 0 [io 0x10c0-0x10df]: assigned959alice # [ 0.303146] pci 0000:00:02.0: BAR 0 [io 0x10e0-0x10ff]: assigned960alice # [ 0.303158] pci 0000:00:04.0: BAR 0 [io 0x1100-0x111f]: assigned961alice # [ 0.303170] pci 0000:00:0c.0: BAR 0 [io 0x1120-0x113f]: assigned962alice # [ 0.303187] pci_bus 0000:00: resource 4 [io 0x0000-0xffff]963alice # [ 0.303191] pci_bus 0000:00: resource 5 [mem 0x10000000-0x3efeffff]964alice # [ 0.303199] pci_bus 0000:00: resource 6 [mem 0x8000000000-0xffffffffff]965alice # [ 0.303751] pci 0000:00:07.0: enabling device (0000 -> 0002)966alice # [ 0.335751] virtio-pci 0000:00:01.0: enabling device (0000 -> 0003)967clare # [ 0.353709] virtio-pci 0000:00:04.0: enabling device (0000 -> 0003)968clare # [ 0.355507] virtio-pci 0000:00:05.0: enabling device (0000 -> 0002)969bob # [ 0.338673] virtio-pci 0000:00:01.0: enabling device (0000 -> 0003)970bob # [ 0.340207] virtio-pci 0000:00:02.0: enabling device (0000 -> 0003)971clare # [ 0.358260] virtio-pci 0000:00:06.0: enabling device (0000 -> 0002)972clare # [ 0.359627] virtio-pci 0000:00:08.0: enabling device (0000 -> 0002)973clare # [ 0.361059] virtio-pci 0000:00:09.0: enabling device (0000 -> 0002)974alice # [ 0.345518] virtio-pci 0000:00:02.0: enabling device (0000 -> 0003)975alice # [ 0.347757] virtio-pci 0000:00:03.0: enabling device (0000 -> 0003)976bob # [ 0.349628] virtio-pci 0000:00:03.0: enabling device (0000 -> 0003)977bob # [ 0.351808] virtio-pci 0000:00:04.0: enabling device (0000 -> 0003)978clare # [ 0.370422] virtio-pci 0000:00:0a.0: enabling device (0000 -> 0002)979clare # [ 0.372030] virtio-pci 0000:00:0b.0: enabling device (0000 -> 0003)980clare # [ 0.375051] virtio-pci 0000:00:0c.0: enabling device (0000 -> 0003)981alice # [ 0.357351] virtio-pci 0000:00:04.0: enabling device (0000 -> 0003)982bob # [ 0.361530] virtio-pci 0000:00:05.0: enabling device (0000 -> 0002)983bob # [ 0.364192] virtio-pci 0000:00:06.0: enabling device (0000 -> 0002)984alice # [ 0.361149] virtio-pci 0000:00:05.0: enabling device (0000 -> 0002)985alice # [ 0.363030] virtio-pci 0000:00:06.0: enabling device (0000 -> 0002)986bob # [ 0.366726] virtio-pci 0000:00:08.0: enabling device (0000 -> 0002)987bob # [ 0.368217] virtio-pci 0000:00:09.0: enabling device (0000 -> 0002)988clare # [ 0.386499] Serial: 8250/16550 driver, 4 ports, IRQ sharing enabled989clare # [ 0.387455] msm_serial: driver initialized990clare # [ 0.387542] SuperH (H)SCI(F) driver initialized991clare # [ 0.387584] STM32 USART driver initialized992alice # [ 0.372477] virtio-pci 0000:00:08.0: enabling device (0000 -> 0002)993alice # [ 0.374169] virtio-pci 0000:00:09.0: enabling device (0000 -> 0002)994alice # [ 0.375759] virtio-pci 0000:00:0a.0: enabling device (0000 -> 0002)995bob # [ 0.377528] virtio-pci 0000:00:0a.0: enabling device (0000 -> 0002)996bob # [ 0.379105] virtio-pci 0000:00:0b.0: enabling device (0000 -> 0003)997alice # [ 0.378678] virtio-pci 0000:00:0b.0: enabling device (0000 -> 0003)998bob # [ 0.381129] virtio-pci 0000:00:0c.0: enabling device (0000 -> 0003)999clare # [ 0.408647] loop: module loaded1000clare # [ 0.408774] virtio_blk virtio2: 1/0/0 default/read/poll queues1001alice # [ 0.388416] virtio-pci 0000:00:0c.0: enabling device (0000 -> 0003)1002alice # [ 0.391986] Serial: 8250/16550 driver, 4 ports, IRQ sharing enabled1003bob # [ 0.394140] Serial: 8250/16550 driver, 4 ports, IRQ sharing enabled1004bob # [ 0.395160] msm_serial: driver initialized1005bob # [ 0.395240] SuperH (H)SCI(F) driver initialized1006bob # [ 0.395280] STM32 USART driver initialized1007alice # [ 0.394050] msm_serial: driver initialized1008alice # [ 0.394137] SuperH (H)SCI(F) driver initialized1009alice # [ 0.394178] STM32 USART driver initialized1010clare # [ 0.417476] virtio_blk virtio2: [vda] 2097152 512-byte logical blocks (1.07 GB/1.00 GiB)1011clare # [ 0.421596] megasas: 07.734.00.00-rc11012clare # [ 0.422093] physmap-flash 0.flash: physmap platform flash device: [mem 0x00000000-0x03ffffff]1013clare # [ 0.424402] 0.flash: Found 2 x16 devices at 0x0 in 32-bit bank. Manufacturer ID 0x000000 Chip ID 0x0000001014clare # [ 0.424429] Intel/Sharp Extended Query Table at 0x00311015clare # [ 0.426069] Using buffer write method1016clare # [ 0.426123] physmap-flash 0.flash: physmap platform flash device: [mem 0x04000000-0x07ffffff]1017clare # [ 0.427864] 0.flash: Found 2 x16 devices at 0x0 in 32-bit bank. Manufacturer ID 0x000000 Chip ID 0x0000001018clare # [ 0.427875] Intel/Sharp Extended Query Table at 0x00311019bob # [ 0.418315] loop: module loaded1020bob # [ 0.418449] virtio_blk virtio2: 1/0/0 default/read/poll queues1021bob # [ 0.419039] virtio_blk virtio2: [vda] 2097152 512-byte logical blocks (1.07 GB/1.00 GiB)1022alice # [ 0.418321] loop: module loaded1023alice # [ 0.418453] virtio_blk virtio2: 1/0/0 default/read/poll queues1024alice # [ 0.419054] virtio_blk virtio2: [vda] 2097152 512-byte logical blocks (1.07 GB/1.00 GiB)1025bob # [ 0.423103] megasas: 07.734.00.00-rc11026bob # [ 0.423583] physmap-flash 0.flash: physmap platform flash device: [mem 0x00000000-0x03ffffff]1027clare # [ 0.441228] Using buffer write method1028clare # [ 0.441241] Concatenating MTD devices:1029clare # [ 0.441243] (0): "0.flash"1030clare # [ 0.441245] (1): "0.flash"1031clare # [ 0.441247] into device "0.flash"1032alice # [ 0.422122] megasas: 07.734.00.00-rc11033alice # [ 0.422622] physmap-flash 0.flash: physmap platform flash device: [mem 0x00000000-0x03ffffff]1034bob # [ 0.427111] 0.flash: Found 2 x16 devices at 0x0 in 32-bit bank. Manufacturer ID 0x000000 Chip ID 0x0000001035bob # [ 0.427139] Intel/Sharp Extended Query Table at 0x00311036bob # [ 0.428818] Using buffer write method1037bob # [ 0.428876] physmap-flash 0.flash: physmap platform flash device: [mem 0x04000000-0x07ffffff]1038alice # [ 0.428283] 0.flash: Found 2 x16 devices at 0x0 in 32-bit bank. Manufacturer ID 0x000000 Chip ID 0x0000001039alice # [ 0.428310] Intel/Sharp Extended Query Table at 0x00311040bob # [ 0.439270] 0.flash: Found 2 x16 devices at 0x0 in 32-bit bank. Manufacturer ID 0x000000 Chip ID 0x0000001041bob # [ 0.439283] Intel/Sharp Extended Query Table at 0x00311042bob # [ 0.440937] Using buffer write method1043bob # [ 0.440949] Concatenating MTD devices:1044bob # [ 0.440951] (0): "0.flash"1045alice # [ 0.437716] Using buffer write method1046bob # [ 0.440952] (1): "0.flash"1047bob # [ 0.440954] into device "0.flash"1048alice # [ 0.437781] physmap-flash 0.flash: physmap platform flash device: [mem 0x04000000-0x07ffffff]1049alice # [ 0.439472] 0.flash: Found 2 x16 devices at 0x0 in 32-bit bank. Manufacturer ID 0x000000 Chip ID 0x0000001050alice # [ 0.439484] Intel/Sharp Extended Query Table at 0x00311051alice # [ 0.443288] Using buffer write method1052alice # [ 0.443300] Concatenating MTD devices:1053alice # [ 0.443302] (0): "0.flash"1054alice # [ 0.443304] (1): "0.flash"1055alice # [ 0.443305] into device "0.flash"1056clare # [ 0.653170] Freeing initrd memory: 26948K1057clare # [ 0.659937] tun: Universal TUN/TAP device driver, 1.61058clare # [ 0.662551] thunder_xcv, ver 1.01059clare # [ 0.662567] thunder_bgx, ver 1.01060clare # [ 0.662576] nicpf, ver 1.01061clare # [ 0.662901] e1000: Intel(R) PRO/1000 Network Driver1062clare # [ 0.662906] e1000: Copyright (c) 1999-2006 Intel Corporation.1063clare # [ 0.662918] e1000e: Intel(R) PRO/1000 Network Driver1064clare # [ 0.662923] e1000e: Copyright(c) 1999 - 2015 Intel Corporation.1065clare # [ 0.662934] igb: Intel(R) Gigabit Ethernet Network Driver1066clare # [ 0.662936] igb: Copyright (c) 2007-2014 Intel Corporation.1067clare # [ 0.662946] igbvf: Intel(R) Gigabit Virtual Function Network Driver1068clare # [ 0.662951] igbvf: Copyright (c) 2009 - 2012 Intel Corporation.1069clare # [ 0.663017] sky2: driver version 1.301070clare # [ 0.663859] usbcore: registered new interface driver usb-storage1071clare # [ 0.663933] usbcore: registered new interface driver usbserial_generic1072clare # [ 0.663939] usbserial: USB Serial support registered for generic1073clare # [ 0.664241] hv_vmbus: registering driver hyperv_keyboard1074bob # [ 0.661770] Freeing initrd memory: 26928K1075alice # [ 0.664033] Freeing initrd memory: 26944K1076bob # [ 0.668714] tun: Universal TUN/TAP device driver, 1.61077bob # [ 0.671449] thunder_xcv, ver 1.01078bob # [ 0.671466] thunder_bgx, ver 1.01079bob # [ 0.671475] nicpf, ver 1.01080bob # [ 0.671770] e1000: Intel(R) PRO/1000 Network Driver1081bob # [ 0.671774] e1000: Copyright (c) 1999-2006 Intel Corporation.1082alice # [ 0.670865] tun: Universal TUN/TAP device driver, 1.61083bob # [ 0.671787] e1000e: Intel(R) PRO/1000 Network Driver1084bob # [ 0.671792] e1000e: Copyright(c) 1999 - 2015 Intel Corporation.1085bob # [ 0.671804] igb: Intel(R) Gigabit Ethernet Network Driver1086bob # [ 0.671806] igb: Copyright (c) 2007-2014 Intel Corporation.1087bob # [ 0.671816] igbvf: Intel(R) Gigabit Virtual Function Network Driver1088bob # [ 0.671820] igbvf: Copyright (c) 2009 - 2012 Intel Corporation.1089bob # [ 0.671883] sky2: driver version 1.301090bob # [ 0.672752] usbcore: registered new interface driver usb-storage1091bob # [ 0.672840] usbcore: registered new interface driver usbserial_generic1092alice # [ 0.673509] thunder_xcv, ver 1.01093bob # [ 0.672846] usbserial: USB Serial support registered for generic1094alice # [ 0.673525] thunder_bgx, ver 1.01095alice # [ 0.673534] nicpf, ver 1.01096bob # [ 0.673149] hv_vmbus: registering driver hyperv_keyboard1097alice # [ 0.673898] e1000: Intel(R) PRO/1000 Network Driver1098alice # [ 0.673903] e1000: Copyright (c) 1999-2006 Intel Corporation.1099alice # [ 0.673919] e1000e: Intel(R) PRO/1000 Network Driver1100alice # [ 0.673924] e1000e: Copyright(c) 1999 - 2015 Intel Corporation.1101alice # [ 0.673937] igb: Intel(R) Gigabit Ethernet Network Driver1102bob # [ 0.680484] ehci-pci 0000:00:07.0: EHCI Host Controller1103alice # [ 0.673939] igb: Copyright (c) 2007-2014 Intel Corporation.1104bob # [ 0.680510] ehci-pci 0000:00:07.0: new USB bus registered, assigned bus number 11105alice # [ 0.673948] igbvf: Intel(R) Gigabit Virtual Function Network Driver1106bob # [ 0.680773] ehci-pci 0000:00:07.0: irq 16, io mem 0x100860001107alice # [ 0.673953] igbvf: Copyright (c) 2009 - 2012 Intel Corporation.1108bob # [ 0.681146] rtc-pl031 9010000.pl031: registered as rtc01109alice # [ 0.674027] sky2: driver version 1.301110bob # [ 0.681171] rtc-pl031 9010000.pl031: setting system clock to 2026-10-07T05:20:48 UTC (1791350448)1111alice # [ 0.674891] usbcore: registered new interface driver usb-storage1112bob # [ 0.681342] i2c_dev: i2c /dev entries driver1113alice # [ 0.674968] usbcore: registered new interface driver usbserial_generic1114alice # [ 0.674974] usbserial: USB Serial support registered for generic1115clare # [ 0.671576] ehci-pci 0000:00:07.0: EHCI Host Controller1116alice # [ 0.675281] hv_vmbus: registering driver hyperv_keyboard1117clare # [ 0.671607] ehci-pci 0000:00:07.0: new USB bus registered, assigned bus number 11118alice # [ 0.676248] ehci-pci 0000:00:07.0: EHCI Host Controller1119clare # [ 0.671829] ehci-pci 0000:00:07.0: irq 16, io mem 0x100860001120alice # [ 0.676274] ehci-pci 0000:00:07.0: new USB bus registered, assigned bus number 11121clare # [ 0.672009] rtc-pl031 9010000.pl031: registered as rtc01122clare # [ 0.672035] rtc-pl031 9010000.pl031: setting system clock to 2026-10-07T05:20:48 UTC (1791350448)1123clare # [ 0.672238] i2c_dev: i2c /dev entries driver1124alice # [ 0.683984] ehci-pci 0000:00:07.0: irq 16, io mem 0x100860001125clare # [ 0.673798] sdhci: Secure Digital Host Controller Interface driver1126alice # [ 0.684171] rtc-pl031 9010000.pl031: registered as rtc01127clare # [ 0.673803] sdhci: Copyright(c) Pierre Ossman1128clare # [ 0.673956] Synopsys Designware Multimedia Card Interface Driver1129alice # [ 0.684198] rtc-pl031 9010000.pl031: setting system clock to 2026-10-07T05:20:48 UTC (1791350448)1130clare # [ 0.674135] sdhci-pltfm: SDHCI platform and OF driver helper1131alice # [ 0.684424] i2c_dev: i2c /dev entries driver1132clare # [ 0.675085] hid: raw HID events driver (C) Jiri Kosina1133clare # [ 0.675220] usbcore: registered new interface driver usbhid1134clare # [ 0.675222] usbhid: USB HID core driver1135bob # [ 0.685865] sdhci: Secure Digital Host Controller Interface driver1136bob # [ 0.685871] sdhci: Copyright(c) Pierre Ossman1137bob # [ 0.686016] Synopsys Designware Multimedia Card Interface Driver1138alice # [ 0.687922] sdhci: Secure Digital Host Controller Interface driver1139alice # [ 0.687928] sdhci: Copyright(c) Pierre Ossman1140bob # [ 0.686194] sdhci-pltfm: SDHCI platform and OF driver helper1141bob # [ 0.687042] hid: raw HID events driver (C) Jiri Kosina1142alice # [ 0.688081] Synopsys Designware Multimedia Card Interface Driver1143bob # [ 0.687177] usbcore: registered new interface driver usbhid1144alice # [ 0.688261] sdhci-pltfm: SDHCI platform and OF driver helper1145clare # [ 0.708139] ehci-pci 0000:00:07.0: USB 2.0 started, EHCI 1.001146bob # [ 0.687180] usbhid: USB HID core driver1147clare # [ 0.708336] hw perfevents: enabled with armv8_pmuv3 PMU driver, 7 (0,8000003f) counters available1148bob # [ 0.687851] hw perfevents: enabled with armv8_pmuv3 PMU driver, 7 (0,8000003f) counters available1149clare # [ 0.709232] drop_monitor: Initializing network drop monitor service1150bob # [ 0.688684] drop_monitor: Initializing network drop monitor service1151clare # [ 0.709396] NET: Registered PF_INET6 protocol family1152bob # [ 0.688790] NET: Registered PF_INET6 protocol family1153clare # [ 0.709840] hub 1-0:1.0: USB hub found1154clare # [ 0.709859] hub 1-0:1.0: 6 ports detected1155bob # [ 0.689427] ehci-pci 0000:00:07.0: USB 2.0 started, EHCI 1.001156bob # [ 0.689805] hub 1-0:1.0: USB hub found1157alice # [ 0.691014] hid: raw HID events driver (C) Jiri Kosina1158bob # [ 0.689824] hub 1-0:1.0: 6 ports detected1159alice # [ 0.691154] usbcore: registered new interface driver usbhid1160clare # [ 0.713266] Segment Routing with IPv61161alice # [ 0.691157] usbhid: USB HID core driver1162clare # [ 0.713283] In-situ OAM (IOAM) with IPv61163clare # [ 0.713353] NET: Registered PF_PACKET protocol family1164alice # [ 0.691842] hw perfevents: enabled with armv8_pmuv3 PMU driver, 7 (0,8000003f) counters available1165bob # [ 0.695623] Segment Routing with IPv61166bob # [ 0.695642] In-situ OAM (IOAM) with IPv61167bob # [ 0.695703] NET: Registered PF_PACKET protocol family1168bob # [ 0.695770] 9pnet: Installing 9P2000 support1169bob # [ 0.695800] Key type dns_resolver registered1170alice # [ 0.694208] ehci-pci 0000:00:07.0: USB 2.0 started, EHCI 1.001171alice # [ 0.694550] hub 1-0:1.0: USB hub found1172clare # [ 0.714449] 9pnet: Installing 9P2000 support1173alice # [ 0.694569] hub 1-0:1.0: 6 ports detected1174clare # [ 0.714485] Key type dns_resolver registered1175alice # [ 0.695178] drop_monitor: Initializing network drop monitor service1176alice # [ 0.695289] NET: Registered PF_INET6 protocol family1177alice # [ 0.695947] Segment Routing with IPv61178alice # [ 0.695966] In-situ OAM (IOAM) with IPv61179bob # [ 0.700389] registered taskstats version 11180alice # [ 0.696030] NET: Registered PF_PACKET protocol family1181bob # [ 0.700526] Loading compiled-in X.509 certificates1182alice # [ 0.696092] 9pnet: Installing 9P2000 support1183alice # [ 0.696126] Key type dns_resolver registered1184clare # [ 0.717956] registered taskstats version 11185clare # [ 0.718091] Loading compiled-in X.509 certificates1186alice # [ 0.702602] registered taskstats version 11187alice # [ 0.702758] Loading compiled-in X.509 certificates1188clare # [ 0.723376] Demotion targets for Node 0: null1189clare # [ 0.723450] Key type .fscrypt registered1190clare # [ 0.723456] Key type fscrypt-provisioning registered1191clare # [ 0.723560] ima: No TPM chip found, activating TPM-bypass!1192clare # [ 0.723571] ima: Allocated hash algorithm: sha11193clare # [ 0.723626] ima: No architecture policies found1194bob # [ 0.706020] Demotion targets for Node 0: null1195bob # [ 0.706105] Key type .fscrypt registered1196clare # [ 0.724095] input: gpio-keys as /devices/platform/gpio-keys/input/input01197bob # [ 0.706111] Key type fscrypt-provisioning registered1198bob # [ 0.706224] ima: No TPM chip found, activating TPM-bypass!1199bob # [ 0.706234] ima: Allocated hash algorithm: sha11200alice # [ 0.708053] Demotion targets for Node 0: null1201bob # [ 0.706298] ima: No architecture policies found1202alice # [ 0.708129] Key type .fscrypt registered1203alice # [ 0.708136] Key type fscrypt-provisioning registered1204bob # [ 0.706731] input: gpio-keys as /devices/platform/gpio-keys/input/input01205alice # [ 0.708243] ima: No TPM chip found, activating TPM-bypass!1206alice # [ 0.708254] ima: Allocated hash algorithm: sha11207alice # [ 0.708308] ima: No architecture policies found1208alice # [ 0.711247] input: gpio-keys as /devices/platform/gpio-keys/input/input01209clare # [ 0.736962] clk: Disabling unused clocks1210clare # [ 0.736971] PM: genpd: Disabling unused power domains1211bob # [ 0.719432] clk: Disabling unused clocks1212bob # [ 0.719441] PM: genpd: Disabling unused power domains1213clare # [ 0.739958] Freeing unused kernel memory: 4736K1214clare # [ 0.740036] Run /init as init process1215bob # [ 0.722482] Freeing unused kernel memory: 4736K1216bob # [ 0.722564] Run /init as init process1217alice # [ 0.721631] clk: Disabling unused clocks1218alice # [ 0.721641] PM: genpd: Disabling unused power domains1219alice # [ 0.723932] Freeing unused kernel memory: 4736K1220alice # [ 0.724030] Run /init as init process1221bob # [ 0.743871] systemd[1]: Successfully made /usr/ read-only.1222clare # [ 0.763629] systemd[1]: Successfully made /usr/ read-only.1223alice # [ 0.746755] systemd[1]: Successfully made /usr/ read-only.1224clare # [ 0.957260] usb 1-1: new high-speed USB device number 2 using ehci-pci1225bob # [ 0.941443] usb 1-1: new high-speed USB device number 2 using ehci-pci1226alice # [ 0.944622] usb 1-1: new high-speed USB device number 2 using ehci-pci1227bob # [ 1.078022] systemd[1]: systemd 261.3 running in system mode (+PAM +AUDIT -SELINUX +APPARMOR +IMA +IPE +SMACK +SECCOMP +GCRYPT -GNUTLS +OPENSSL +ACL +BLKID +CURL +ELFUTILS +FIDO2 +IDN2 +KMOD +LIBCRYPTSETUP +LIBCRYPTSETUP_PLUGINS +LIBFDISK +PCRE2 +PWQUALITY +P11KIT +QRENCODE +TPM2 +BZIP2 +LZ4 +XZ +ZLIB +ZSTD +BPF_FRAMEWORK -BTF -XKBCOMMON +UTMP +LIBARCHIVE)1228bob # [ 1.078052] systemd[1]: Detected virtualization qemu.1229clare # [ 1.097699] systemd[1]: systemd 261.3 running in system mode (+PAM +AUDIT -SELINUX +APPARMOR +IMA +IPE +SMACK +SECCOMP +GCRYPT -GNUTLS +OPENSSL +ACL +BLKID +CURL +ELFUTILS +FIDO2 +IDN2 +KMOD +LIBCRYPTSETUP +LIBCRYPTSETUP_PLUGINS +LIBFDISK +PCRE2 +PWQUALITY +P11KIT +QRENCODE +TPM2 +BZIP2 +LZ4 +XZ +ZLIB +ZSTD +BPF_FRAMEWORK -BTF -XKBCOMMON +UTMP +LIBARCHIVE)1230clare # [ 1.097731] systemd[1]: Detected virtualization qemu.1231bob # [ 1.078092] systemd[1]: Detected architecture arm64.1232bob # [ 1.078101] systemd[1]: Running in initrd.1233clare # [ 1.097772] systemd[1]: Detected architecture arm64.1234bob # [ 1.078913] systemd[1]: Initializing machine ID from random generator.1235clare # [ 1.097781] systemd[1]: Running in initrd.1236alice # [ 1.080893] systemd[1]: systemd 261.3 running in system mode (+PAM +AUDIT -SELINUX +APPARMOR +IMA +IPE +SMACK +SECCOMP +GCRYPT -GNUTLS +OPENSSL +ACL +BLKID +CURL +ELFUTILS +FIDO2 +IDN2 +KMOD +LIBCRYPTSETUP +LIBCRYPTSETUP_PLUGINS +LIBFDISK +PCRE2 +PWQUALITY +P11KIT +QRENCODE +TPM2 +BZIP2 +LZ4 +XZ +ZLIB +ZSTD +BPF_FRAMEWORK -BTF -XKBCOMMON +UTMP +LIBARCHIVE)1237bob # [ 1.079180] systemd[1]: Hostname set to <bob>.1238clare # [ 1.098651] systemd[1]: Initializing machine ID from random generator.1239alice # [ 1.080924] systemd[1]: Detected virtualization qemu.1240clare # [ 1.098940] systemd[1]: Hostname set to <clare>.1241alice # [ 1.080965] systemd[1]: Detected architecture arm64.1242alice # [ 1.080975] systemd[1]: Running in initrd.1243alice # [ 1.081753] systemd[1]: Initializing machine ID from random generator.1244alice # [ 1.082174] systemd[1]: Hostname set to <alice>.1245bob # [ 1.101210] input: QEMU QEMU USB Keyboard as /devices/platform/4010000000.pcie/pci0000:00/0000:00:07.0/usb1/1-1/1-1:1.0/0003:0627:0001.0001/input/input11246clare # [ 1.120766] input: QEMU QEMU USB Keyboard as /devices/platform/4010000000.pcie/pci0000:00/0000:00:07.0/usb1/1-1/1-1:1.0/0003:0627:0001.0001/input/input11247alice # [ 1.103811] input: QEMU QEMU USB Keyboard as /devices/platform/4010000000.pcie/pci0000:00/0000:00:07.0/usb1/1-1/1-1:1.0/0003:0627:0001.0001/input/input11248bob # [ 1.189554] hid-generic 0003:0627:0001.0001: input,hidraw0: USB HID v1.11 Keyboard [QEMU QEMU USB Keyboard] on usb-0000:00:07.0-1/input01249clare # [ 1.209379] hid-generic 0003:0627:0001.0001: input,hidraw0: USB HID v1.11 Keyboard [QEMU QEMU USB Keyboard] on usb-0000:00:07.0-1/input01250alice # [ 1.192524] hid-generic 0003:0627:0001.0001: input,hidraw0: USB HID v1.11 Keyboard [QEMU QEMU USB Keyboard] on usb-0000:00:07.0-1/input01251bob # [ 1.216175] systemd[1]: bpf-restrict-fs: LSM BPF program attached1252clare # [ 1.233661] systemd[1]: bpf-restrict-fs: LSM BPF program attached1253alice # [ 1.217182] systemd[1]: bpf-restrict-fs: LSM BPF program attached1254clare # [ 1.283042] systemd[1]: Queued start job for default target Initrd Default Target.1255bob # [ 1.267249] systemd[1]: Queued start job for default target Initrd Default Target.1256clare # [ 1.287313] systemd[1]: Created slice Slice /system/modprobe.1257alice # [ 1.266557] systemd[1]: Queued start job for default target Initrd Default Target.1258clare # [ 1.287457] systemd[1]: Started Dispatch Password Requests to Console Directory Watch.1259clare # [ 1.287487] systemd[1]: Expecting device /dev/disk/by-label/nixos...1260clare # [ 1.287507] systemd[1]: Reached target Path Units.1261clare # [ 1.287519] systemd[1]: Reached target Slice Units.1262clare # [ 1.287531] systemd[1]: Reached target Swaps.1263clare # [ 1.287542] systemd[1]: Reached target Timer Units.1264clare # [ 1.287666] systemd[1]: Listening on D-Bus System Message Bus Socket.1265clare # [ 1.287773] systemd[1]: Listening on Journal Socket (/dev/log).1266alice # [ 1.270451] systemd[1]: Created slice Slice /system/modprobe.1267clare # [ 1.287880] systemd[1]: Listening on Journal Sockets.1268alice # [ 1.270596] systemd[1]: Started Dispatch Password Requests to Console Directory Watch.1269clare # [ 1.287946] systemd[1]: Listening on udev Control Socket.1270alice # [ 1.270624] systemd[1]: Expecting device /dev/disk/by-label/nixos...1271clare # [ 1.287988] systemd[1]: Listening on udev Kernel Socket.1272alice # [ 1.270643] systemd[1]: Reached target Path Units.1273clare # [ 1.288002] systemd[1]: Reached target Socket Units.1274alice # [ 1.270654] systemd[1]: Reached target Slice Units.1275clare # [ 1.289028] systemd[1]: Starting Create List of Static Device Nodes...1276alice # [ 1.270666] systemd[1]: Reached target Swaps.1277bob # [ 1.274833] systemd[1]: Created slice Slice /system/modprobe.1278alice # [ 1.270676] systemd[1]: Reached target Timer Units.1279clare # [ 1.289077] systemd[1]: Load Kernel Module configfs skipped, unmet condition check ConditionKernelModuleLoaded=!configfs1280alice # [ 1.270804] systemd[1]: Listening on D-Bus System Message Bus Socket.1281bob # [ 1.274972] systemd[1]: Started Dispatch Password Requests to Console Directory Watch.1282alice # [ 1.270915] systemd[1]: Listening on Journal Socket (/dev/log).1283bob # [ 1.275001] systemd[1]: Expecting device /dev/disk/by-label/nixos...1284alice # [ 1.271032] systemd[1]: Listening on Journal Sockets.1285bob # [ 1.275022] systemd[1]: Reached target Path Units.1286alice # [ 1.271102] systemd[1]: Listening on udev Control Socket.1287bob # [ 1.275034] systemd[1]: Reached target Slice Units.1288alice # [ 1.271144] systemd[1]: Listening on udev Kernel Socket.1289bob # [ 1.275046] systemd[1]: Reached target Swaps.1290alice # [ 1.271157] systemd[1]: Reached target Socket Units.1291bob # [ 1.275057] systemd[1]: Reached target Timer Units.1292alice # [ 1.272217] systemd[1]: Starting Create List of Static Device Nodes...1293bob # [ 1.275183] systemd[1]: Listening on D-Bus System Message Bus Socket.1294bob # [ 1.275297] systemd[1]: Listening on Journal Socket (/dev/log).1295alice # [ 1.272270] systemd[1]: Load Kernel Module configfs skipped, unmet condition check ConditionKernelModuleLoaded=!configfs1296clare # [ 1.297978] systemd[1]: Mounting Kernel Configuration File System...1297bob # [ 1.275609] systemd[1]: Listening on Journal Sockets.1298bob # [ 1.275683] systemd[1]: Listening on udev Control Socket.1299bob # [ 1.275727] systemd[1]: Listening on udev Kernel Socket.1300bob # [ 1.275740] systemd[1]: Reached target Socket Units.1301bob # [ 1.276817] systemd[1]: Starting Create List of Static Device Nodes...1302alice # [ 1.281271] systemd[1]: Mounting Kernel Configuration File System...1303bob # [ 1.276868] systemd[1]: Load Kernel Module configfs skipped, unmet condition check ConditionKernelModuleLoaded=!configfs1304clare # [ 1.307176] systemd[1]: Starting Journal Service...1305bob # [ 1.293191] systemd[1]: Mounting Kernel Configuration File System...1306alice # [ 1.288528] systemd[1]: Starting Journal Service...1307clare # [ 1.316091] systemd[1]: Starting Load Kernel Modules...1308clare # [ 1.316160] systemd[1]: Early TPM SRK Setup skipped, unmet condition check ConditionSecurity=measured-os1309bob # [ 1.298973] systemd[1]: Starting Journal Service...1310bob # [ 1.304669] systemd[1]: Starting Load Kernel Modules...1311bob # [ 1.304740] systemd[1]: Early TPM SRK Setup skipped, unmet condition check ConditionSecurity=measured-os1312alice # [ 1.312444] usb 1-2: new high-speed USB device number 3 using ehci-pci1313bob # [ 1.309583] usb 1-2: new high-speed USB device number 3 using ehci-pci1314alice # [ 1.317113] systemd[1]: Starting Load Kernel Modules...1315alice # [ 1.317187] systemd[1]: Early TPM SRK Setup skipped, unmet condition check ConditionSecurity=measured-os1316alice # [ 1.317980] systemd[1]: Starting Coldplug All udev Devices...1317clare # [ 1.333228] usb 1-2: new high-speed USB device number 3 using ehci-pci1318clare # [ 1.333539] systemd[1]: Starting Coldplug All udev Devices...1319bob # [ 1.324856] systemd[1]: Starting Coldplug All udev Devices...1320bob # [ 1.329048] systemd[1]: Finished Create List of Static Device Nodes.1321clare # [ 1.345299] systemd[1]: Finished Create List of Static Device Nodes.1322clare # [ 1.346146] systemd[1]: Mounted Kernel Configuration File System.1323bob # [ 1.330407] systemd[1]: Mounted Kernel Configuration File System.1324clare # [ 1.353433] systemd[1]: Starting Create Static Device Nodes in /dev gracefully...1325alice # [ 1.336466] systemd[1]: Finished Create List of Static Device Nodes.1326alice # [ 1.339468] systemd-journald[71]: Collecting audit messages is disabled.1327clare # [ 1.360285] device-mapper: core: CONFIG_IMA_DISABLE_HTABLE is disabled. Duplicate IMA measurements will not be recorded in the IMA log.1328bob # [ 1.342158] systemd[1]: Starting Create Static Device Nodes in /dev gracefully...1329bob # [ 1.350718] device-mapper: core: CONFIG_IMA_DISABLE_HTABLE is disabled. Duplicate IMA measurements will not be recorded in the IMA log.1330bob # [ 1.354572] device-mapper: ioctl: 4.50.0-ioctl (2025-04-28) initialised: dm-devel@lists.linux.dev1331clare # [ 1.373320] device-mapper: ioctl: 4.50.0-ioctl (2025-04-28) initialised: dm-devel@lists.linux.dev1332alice # [ 1.359181] device-mapper: core: CONFIG_IMA_DISABLE_HTABLE is disabled. Duplicate IMA measurements will not be recorded in the IMA log.1333bob # [ 1.363203] [drm] pci: virtio-gpu-pci detected at 0000:00:05.01334bob # [ 1.363434] [drm] features: -virgl +edid -resource_blob -host_visible1335bob # [ 1.363436] [drm] features: -context_init1336bob # [ 1.363886] [drm] number of scanouts: 11337bob # [ 1.363894] [drm] number of cap sets: 01338alice # [ 1.361517] systemd[1]: Starting Create Static Device Nodes in /dev gracefully...1339alice # [ 1.361902] systemd[1]: Mounted Kernel Configuration File System.1340clare # [ 1.385630] systemd[1]: Finished Create Static Device Nodes in /dev gracefully.1341clare # [ 1.386661] systemd[1]: Starting Create Static Device Nodes in /dev...1342alice # [ 1.368472] device-mapper: ioctl: 4.50.0-ioctl (2025-04-28) initialised: dm-devel@lists.linux.dev1343clare # [ 1.392058] [drm] pci: virtio-gpu-pci detected at 0000:00:05.01344clare # [ 1.392354] [drm] features: -virgl +edid -resource_blob -host_visible1345clare # [ 1.392356] [drm] features: -context_init1346clare # [ 1.392808] [drm] number of scanouts: 11347clare # [ 1.392820] [drm] number of cap sets: 01348bob # [ 1.381098] systemd-journald[71]: Collecting audit messages is disabled.1349clare # [ 1.400926] systemd-journald[71]: Collecting audit messages is disabled.1350alice # [ 1.381006] systemd[1]: Finished Create Static Device Nodes in /dev gracefully.1351alice # [ 1.382129] systemd[1]: Starting Create Static Device Nodes in /dev...1352bob # [ 1.385818] systemd[1]: Finished Create Static Device Nodes in /dev gracefully.1353bob # [ 1.386917] systemd[1]: Starting Create Static Device Nodes in /dev...1354clare # [ 1.405494] virtio-pci 0000:00:05.0: [drm] Registered 1 planes with drm panic1355clare # [ 1.405501] [drm] Initialized virtio_gpu 0.1.0 for 0000:00:05.0 on minor 01356bob # [ 1.390834] virtio-pci 0000:00:05.0: [drm] Registered 1 planes with drm panic1357bob # [ 1.390842] [drm] Initialized virtio_gpu 0.1.0 for 0000:00:05.0 on minor 01358alice # [ 1.390147] [drm] pci: virtio-gpu-pci detected at 0000:00:05.01359alice # [ 1.390360] [drm] features: -virgl +edid -resource_blob -host_visible1360alice # [ 1.390362] [drm] features: -context_init1361alice # [ 1.390944] [drm] number of scanouts: 11362alice # [ 1.390953] [drm] number of cap sets: 01363alice # [ 1.400654] virtio-pci 0000:00:05.0: [drm] Registered 1 planes with drm panic1364alice # [ 1.400662] [drm] Initialized virtio_gpu 0.1.0 for 0000:00:05.0 on minor 01365clare # [ 1.422394] Console: switching to colour frame buffer device 160x501366bob # [ 1.405817] Console: switching to colour frame buffer device 160x501367clare # [ 1.437662] systemd[1]: Finished Create Static Device Nodes in /dev.1368clare # [ 1.437800] systemd[1]: Reached target Preparation for Local File Systems.1369clare # [ 1.437818] systemd[1]: Reached target Local File Systems.1370alice # [ 1.418836] systemd[1]: Started Journal Service.1371clare # [ 1.442938] systemd[1]: Starting Rule-based Manager for Device Events and Files...1372alice # [ 1.419894] Console: switching to colour frame buffer device 160x501373alice # [ 1.420123] systemd-modules-load[73]: Inserted module 'dm_mod'1374bob # [ 1.426162] virtio-pci 0000:00:05.0: [drm] fb0: virtio_gpudrmfb frame buffer device1375alice # [ 1.421630] systemd-modules-load[73]: Module 'virtio_balloon' is built in1376clare # [ 1.449850] virtio-pci 0000:00:05.0: [drm] fb0: virtio_gpudrmfb frame buffer device1377alice # [ 1.425473] systemd-modules-load[73]: Module 'virtio_console' is built in1378bob # [ 1.433835] systemd[1]: Finished Create Static Device Nodes in /dev.1379alice # [ 1.427377] systemd[1]: Finished Create Static Device Nodes in /dev.1380bob # [ 1.433996] systemd[1]: Reached target Preparation for Local File Systems.1381bob # [ 1.434026] systemd[1]: Reached target Local File Systems.1382bob # [ 1.435184] systemd[1]: Starting Rule-based Manager for Device Events and Files...1383alice # [ 1.432218] systemd[1]: Reached target Preparation for Local File Systems.1384alice # [ 1.436811] systemd[1]: Reached target Local File Systems.1385alice # [ 1.438454] systemd[1]: Starting Create System Files and Directories...1386alice # [ 1.444833] virtio-pci 0000:00:05.0: [drm] fb0: virtio_gpudrmfb frame buffer device1387clare # [ 1.468682] systemd[1]: Finished Load Kernel Modules.1388bob # [ 1.449726] systemd[1]: Finished Load Kernel Modules.1389alice # [ 1.444374] systemd-modules-load[73]: Inserted module 'virtio_gpu'1390alice # [ 1.444978] systemd-modules-load[73]: Module 'virtio_rng' is built in1391clare # [ 1.470940] systemd[1]: Starting Apply Kernel Variables...1392clare # [ 1.468526] systemd-modules-load[72]: Inserted module 'dm_mod'1393clare # [ 1.469438] systemd-modules-load[72]: Module 'virtio_balloon' is built in1394clare # [ 1.472163] systemd-modules-load[72]: Module 'virtio_console' is built in1395alice # [ 1.452834] systemd[1]: Starting Rule-based Manager for Device Events and Files...1396clare # [ 1.479372] systemd[1]: Started Journal Service.1397alice # [ 1.454454] systemd[1]: Finished Load Kernel Modules.1398bob # [ 1.463059] systemd[1]: Starting Apply Kernel Variables...1399bob # [ 1.465040] input: QEMU QEMU USB Tablet as /devices/platform/4010000000.pcie/pci0000:00/0000:00:07.0/usb1/1-2/1-2:1.0/0003:0627:0001.0002/input/input21400bob # [ 1.465223] hid-generic 0003:0627:0001.0002: input,hidraw1: USB HID v0.01 Mouse [QEMU QEMU USB Tablet] on usb-0000:00:07.0-2/input01401clare # [ 1.477489] systemd-modules-load[72]: Inserted module 'virtio_gpu'1402clare # [ 1.485745] input: QEMU QEMU USB Tablet as /devices/platform/4010000000.pcie/pci0000:00/0000:00:07.0/usb1/1-2/1-2:1.0/0003:0627:0001.0002/input/input21403clare # [ 1.485905] hid-generic 0003:0627:0001.0002: input,hidraw1: USB HID v0.01 Mouse [QEMU QEMU USB Tablet] on usb-0000:00:07.0-2/input01404alice # [ 1.470452] input: QEMU QEMU USB Tablet as /devices/platform/4010000000.pcie/pci0000:00/0000:00:07.0/usb1/1-2/1-2:1.0/0003:0627:0001.0002/input/input21405alice # [ 1.470615] hid-generic 0003:0627:0001.0002: input,hidraw1: USB HID v0.01 Mouse [QEMU QEMU USB Tablet] on usb-0000:00:07.0-2/input01406clare # [ 1.485208] systemd-modules-load[72]: Module 'virtio_rng' is built in1407bob # [ 1.469215] systemd-modules-load[72]: Inserted module 'dm_mod'1408alice # [ 1.469053] systemd[1]: Starting Apply Kernel Variables...1409bob # [ 1.477567] systemd[1]: Started Journal Service.1410bob # [ 1.472708] systemd-modules-load[72]: Module 'virtio_balloon' is built in1411bob # [ 1.473462] systemd-modules-load[72]: Module 'virtio_console' is built in1412bob # [ 1.474196] systemd-modules-load[72]: Inserted module 'virtio_gpu'1413bob # [ 1.474906] systemd-modules-load[72]: Module 'virtio_rng' is built in1414clare # [ 1.500098] systemd[1]: Starting Create System Files and Directories...1415bob # [ 1.486395] systemd[1]: Starting Create System Files and Directories...1416clare # [ 1.515194] systemd[1]: Finished Apply Kernel Variables.1417alice # [ 1.500528] systemd[1]: Finished Create System Files and Directories.1418clare # [ 1.523592] systemd-udevd[79]: Using default interface naming scheme 'v261'.1419bob # [ 1.512122] systemd[1]: Finished Apply Kernel Variables.1420bob # [ 1.513742] systemd-udevd[79]: Using default interface naming scheme 'v261'.1421alice # [ 1.516734] systemd[1]: Finished Apply Kernel Variables.1422clare # [ 1.537865] systemd[1]: Finished Create System Files and Directories.1423bob # [ 1.520668] systemd[1]: Finished Create System Files and Directories.1424clare # [ 1.548487] systemd[1]: Started Rule-based Manager for Device Events and Files.1425alice # [ 1.534523] systemd-udevd[81]: Using default interface naming scheme 'v261'.1426bob # [ 1.536313] systemd[1]: Started Rule-based Manager for Device Events and Files.1427alice # [ 1.552802] systemd[1]: Started Rule-based Manager for Device Events and Files.1428clare # [ 1.597166] systemd[1]: Starting Virtual Console Setup...1429bob # [ 1.584081] systemd[1]: Starting Virtual Console Setup...1430alice # [ 1.612204] systemd[1]: Starting Virtual Console Setup...1431clare # [ 1.640343] systemd-vconsole-setup[101]: Configuration of first virtual console was skipped, ignoring remaining ones.1432clare # [ 1.644111] systemd[1]: Finished Virtual Console Setup.1433bob # [ 1.633426] systemd-vconsole-setup[101]: Configuration of first virtual console was skipped, ignoring remaining ones.1434bob # [ 1.634510] systemd[1]: Finished Virtual Console Setup.1435alice # [ 1.652342] systemd-vconsole-setup[101]: Configuration of first virtual console was skipped, ignoring remaining ones.1436alice # [ 1.654541] systemd[1]: Finished Virtual Console Setup.1437bob # [ 1.856994] systemd[1]: Finished Coldplug All udev Devices.1438bob # [ 1.857606] systemd[1]: Reached target System Initialization.1439bob # [ 1.858135] systemd[1]: Reached target Basic System.1440alice # [ 1.860118] systemd[1]: Finished Coldplug All udev Devices.1441alice # [ 1.860723] systemd[1]: Reached target System Initialization.1442alice # [ 1.861261] systemd[1]: Reached target Basic System.1443clare # [ 1.885333] systemd[1]: Finished Coldplug All udev Devices.1444clare # [ 1.885957] systemd[1]: Reached target System Initialization.1445clare # [ 1.886546] systemd[1]: Reached target Basic System.1446clare # [ 1.974268] (udev-worker)[94]: Network interface NamePolicy= disabled on kernel command line.1447bob # [ 1.958837] (udev-worker)[92]: Network interface NamePolicy= disabled on kernel command line.1448alice # [ 1.983851] (udev-worker)[100]: Network interface NamePolicy= disabled on kernel command line.1449bob # [ 1.986204] (udev-worker)[99]: Network interface NamePolicy= disabled on kernel command line.1450clare # [ 2.004337] (udev-worker)[99]: Network interface NamePolicy= disabled on kernel command line.1451alice # [ 1.996985] (udev-worker)[94]: Network interface NamePolicy= disabled on kernel command line.1452bob # [ 2.034124] systemd[1]: Found device /dev/disk/by-label/nixos.1453bob # [ 2.036295] systemd[1]: Reached target Initrd Root Device.1454bob # [ 2.038693] systemd[1]: Starting File System Check on /dev/disk/by-label/nixos...1455clare # [ 2.073357] systemd[1]: Found device /dev/disk/by-label/nixos.1456clare # [ 2.076137] systemd[1]: Reached target Initrd Root Device.1457alice # [ 2.056863] systemd[1]: Found device /dev/disk/by-label/nixos.1458clare # [ 2.079238] systemd[1]: Starting File System Check on /dev/disk/by-label/nixos...1459alice # [ 2.063770] systemd[1]: Reached target Initrd Root Device.1460alice # [ 2.068581] systemd[1]: Starting File System Check on /dev/disk/by-label/nixos...1461bob # [ 2.085559] systemd-fsck[110]: nixos: clean, 12/65536 files, 13019/262144 blocks1462bob # [ 2.095806] systemd[1]: Finished File System Check on /dev/disk/by-label/nixos.1463clare # [ 2.114135] systemd-fsck[110]: nixos: clean, 12/65536 files, 13019/262144 blocks1464clare # [ 2.121747] systemd[1]: Finished File System Check on /dev/disk/by-label/nixos.1465alice # [ 2.112237] systemd-fsck[110]: nixos: clean, 12/65536 files, 13019/262144 blocks1466alice # [ 2.118536] systemd[1]: Finished File System Check on /dev/disk/by-label/nixos.1467alice # [ 2.312551] systemd[1]: Mounting /sysroot...1468clare # [ 2.333562] systemd[1]: Mounting /sysroot...1469bob # [ 2.318351] systemd[1]: Mounting /sysroot...1470alice # [ 2.342207] EXT4-fs (vda): mounted filesystem 50142622-57b5-4dfa-9490-28a1b3a21de1 r/w with ordered data mode. Quota mode: none.1471alice # [ 2.338104] systemd[1]: Mounted /sysroot.1472alice # [ 2.339417] systemd[1]: Reached target Initrd Root File System.1473clare # [ 2.363515] systemd[1]: Mounted /sysroot.1474alice # [ 2.343943] systemd[1]: Mounting /sysroot/nix/.ro-store...1475clare # [ 2.370041] EXT4-fs (vda): mounted filesystem 3c03a584-5778-40ca-89c8-804af6ee8a0c r/w with ordered data mode. Quota mode: none.1476bob # [ 2.347435] systemd[1]: Mounted /sysroot.1477clare # [ 2.366106] systemd[1]: Reached target Initrd Root File System.1478bob # [ 2.353423] EXT4-fs (vda): mounted filesystem dceae672-475b-4dbd-a218-398d406d48e0 r/w with ordered data mode. Quota mode: none.1479bob # [ 2.349714] systemd[1]: Reached target Initrd Root File System.1480clare # [ 2.370595] systemd[1]: Mounting /sysroot/nix/.ro-store...1481bob # [ 2.353118] systemd[1]: Starting Mountpoints Configured in the Real Root...1482alice # [ 2.355894] systemd[1]: Mounting /sysroot/nix/.rw-store...1483clare # [ 2.382011] systemd[1]: Mounting /sysroot/nix/.rw-store...1484alice # [ 2.364091] systemd[1]: Mounting /sysroot/run...1485clare # [ 2.387081] systemd[1]: Mounting /sysroot/run...1486bob # [ 2.374767] systemd-sysroot-fstab-check[118]: /sysroot should be mounted in the initrd, will request daemon-reload.1487bob # [ 2.380221] systemd[1]: Reload requested from client PID 118 ('systemd-sysroot') (unit initrd-parse-etc.service)...1488bob # [ 2.383342] systemd[1]: Reloading...1489clare # [ 2.402516] systemd[1]: Mounting /sysroot/tmp/shared...1490alice # [ 2.385477] systemd[1]: Mounting /sysroot/tmp/shared...1491alice # [ 2.405841] fuse: init (API version 7.45)1492alice # [ 2.404104] systemd[1]: Mounting /sysroot/tmp/xchg...1493clare # [ 2.436749] fuse: init (API version 7.45)1494alice # [ 2.418909] virtiofs virtio6: discovered new tag: nix-store1495alice # [ 2.419426] virtiofs virtio6: virtio_fs_setup_dax: No cache capability1496alice # [ 2.415760] systemd[1]: Starting Mountpoints Configured in the Real Root...1497clare # [ 2.436058] systemd[1]: Mounting /sysroot/tmp/xchg...1498clare # [ 2.440140] systemd[1]: Starting Mountpoints Configured in the Real Root...1499clare # [ 2.445878] systemd[1]: Mounted /sysroot/nix/.rw-store.1500clare # [ 2.453588] virtiofs virtio6: discovered new tag: nix-store1501alice # [ 2.433709] virtiofs virtio7: discovered new tag: shared1502clare # [ 2.454096] virtiofs virtio6: virtio_fs_setup_dax: No cache capability1503alice # [ 2.434217] virtiofs virtio7: virtio_fs_setup_dax: No cache capability1504alice # [ 2.436050] virtiofs virtio8: discovered new tag: xchg1505alice # [ 2.443383] virtiofs virtio8: virtio_fs_setup_dax: No cache capability1506clare # [ 2.470611] virtiofs virtio7: discovered new tag: shared1507clare # [ 2.471126] virtiofs virtio7: virtio_fs_setup_dax: No cache capability1508clare # [ 2.472879] virtiofs virtio8: discovered new tag: xchg1509alice # [ 2.450441] systemd[1]: Mounted /sysroot/nix/.ro-store.1510clare # [ 2.479773] virtiofs virtio8: virtio_fs_setup_dax: No cache capability1511clare # [ 2.482691] systemd[1]: Starting rw-sysroot-nix-store.service...1512alice # [ 2.465199] systemd[1]: Mounted /sysroot/nix/.rw-store.1513alice # [ 2.467541] systemd-sysroot-fstab-check[124]: /sysroot should be mounted in the initrd, will request daemon-reload.1514alice # [ 2.475042] systemd[1]: Mounted /sysroot/run.1515alice # [ 2.476238] systemd[1]: Mounted /sysroot/tmp/xchg.1516alice # [ 2.484808] systemd[1]: Mounted /sysroot/tmp/shared.1517clare # [ 2.506237] systemd-sysroot-fstab-check[124]: /sysroot should be mounted in the initrd, will request daemon-reload.1518clare # [ 2.507278] systemd[1]: Mounted /sysroot/run.1519alice # [ 2.487298] systemd[1]: Reload requested from client PID 124 ('systemd-sysroot') (unit initrd-parse-etc.service)...1520alice # [ 2.491441] systemd[1]: Reloading...1521clare # [ 2.511346] systemd[1]: Mounted /sysroot/nix/.ro-store.1522clare # [ 2.512953] systemd[1]: Mounted /sysroot/tmp/shared.1523clare # [ 2.514313] systemd[1]: rw-sysroot-nix-store.service: Deactivated successfully.1524clare # [ 2.515817] systemd[1]: Finished rw-sysroot-nix-store.service.1525clare # [ 2.527533] systemd[1]: Mounted /sysroot/tmp/xchg.1526clare # [ 2.529794] systemd[1]: Reload requested from client PID 124 ('systemd-sysroot') (unit initrd-parse-etc.service)...1527clare # [ 2.532685] systemd[1]: Reloading...1528bob # [ 2.564158] systemd[1]: Reloading finished in 182 ms.1529bob # [ 2.592247] systemd-sysroot-fstab-check[118]: Requesting initrd-fs.target/start/replace...1530bob # [ 2.594802] systemd-sysroot-fstab-check[118]: Requesting swap.target/start/replace...1531bob # [ 2.597276] systemd[1]: initrd-parse-etc.service: Deactivated successfully.1532bob # [ 2.599170] systemd[1]: Finished Mountpoints Configured in the Real Root.1533bob # [ 2.600734] systemd[1]: initrd-parse-etc.service: Triggering OnSuccess= dependencies.1534alice # [ 2.660734] systemd[1]: Reloading finished in 170 ms.1535clare # [ 2.698215] systemd[1]: Reloading finished in 166 ms.1536alice # [ 2.681230] systemd-sysroot-fstab-check[124]: Requesting initrd-fs.target/start/replace...1537alice # [ 2.682719] systemd-sysroot-fstab-check[124]: Requesting swap.target/start/replace...1538alice # [ 2.690751] systemd[1]: Starting rw-sysroot-nix-store.service...1539alice # [ 2.692812] systemd[1]: initrd-parse-etc.service: Deactivated successfully.1540alice # [ 2.701829] systemd[1]: Finished Mountpoints Configured in the Real Root.1541alice # [ 2.702468] systemd[1]: initrd-parse-etc.service: Triggering OnSuccess= dependencies.1542clare # [ 2.724583] systemd-sysroot-fstab-check[124]: Requesting initrd-fs.target/start/replace...1543alice # [ 2.705433] systemd[1]: rw-sysroot-nix-store.service: Deactivated successfully.1544alice # [ 2.706150] systemd[1]: Finished rw-sysroot-nix-store.service.1545clare # [ 2.727467] systemd-sysroot-fstab-check[124]: Requesting swap.target/start/replace...1546clare # [ 2.730676] systemd[1]: Starting rw-sysroot-nix-store.service...1547clare # [ 2.732490] systemd[1]: initrd-parse-etc.service: Deactivated successfully.1548clare # [ 2.738424] systemd[1]: Finished Mountpoints Configured in the Real Root.1549clare # [ 2.739154] systemd[1]: initrd-parse-etc.service: Triggering OnSuccess= dependencies.1550clare # [ 2.757972] systemd[1]: rw-sysroot-nix-store.service: Deactivated successfully.1551clare # [ 2.758656] systemd[1]: Finished rw-sysroot-nix-store.service.1552bob # [ 2.779281] fuse: init (API version 7.45)1553bob # [ 2.822615] virtiofs virtio6: discovered new tag: nix-store1554bob # [ 2.823127] virtiofs virtio6: virtio_fs_setup_dax: No cache capability1555bob # [ 2.828969] (udev-worker)[90]: mtd0ro: Failed to find and pin callout binary "/nix/store/8w0qabyr98chcmr4y9hh6h6l26albldx-systemd-261.3/lib/udev/mtd_probe": No such file or directory1556bob # [ 2.833015] (udev-worker)[90]: mtd0ro: /etc/udev/rules.d/75-probe_mtd.rules:5 IMPORT{program}="mtd_probe $devnode": Failed to execute "mtd_probe /dev/mtd0ro", ignoring: No such file or directory1557bob # [ 2.851133] virtiofs virtio7: discovered new tag: shared1558bob # [ 2.851657] virtiofs virtio7: virtio_fs_setup_dax: No cache capability1559bob # [ 2.855416] systemd[1]: systemd-vconsole-setup.service: Deactivated successfully.[ 2.864147] virtiofs virtio8: discovered new tag: xchg1560bob # [ 2.864685] virtiofs virtio8: virtio_fs_setup_dax: No cache capability1561bob # 1562bob # [ 2.859325] systemd[1]: Stopped Virtual Console Setup.1563bob # [ 2.864782] systemd[1]: Stopping Virtual Console Setup...1564bob # [ 2.865464] systemd[1]: Starting Virtual Console Setup...1565bob # [ 2.873881] systemd[1]: systemd-vconsole-setup.service: Deactivated successfully.1566bob # [ 2.875900] systemd[1]: Stopped Virtual Console Setup.1567bob # [ 2.880204] systemd[1]: Starting Virtual Console Setup...1568bob # [ 2.894976] systemd-vconsole-setup[139]: Configuration of first virtual console was skipped, ignoring remaining ones.1569bob # [ 2.897256] systemd[1]: Finished Virtual Console Setup.1570clare # [ 2.938268] (udev-worker)[98]: mtd0ro: Failed to find and pin callout binary "/nix/store/8w0qabyr98chcmr4y9hh6h6l26albldx-systemd-261.3/lib/udev/mtd_probe": No such file or directory1571clare # [ 2.944128] (udev-worker)[98]: mtd0ro: /etc/udev/rules.d/75-probe_mtd.rules:5 IMPORT{program}="mtd_probe $devnode": Failed to execute "mtd_probe /dev/mtd0ro", ignoring: No such file or directory1572clare # [ 2.958872] systemd[1]: systemd-vconsole-setup.service: Deactivated successfully.1573clare # [ 2.960382] systemd[1]: Stopped Virtual Console Setup.1574clare # [ 2.963890] systemd[1]: Stopping Virtual Console Setup...1575clare # [ 2.964547] systemd[1]: Starting Virtual Console Setup...1576clare # [ 2.971828] systemd[1]: systemd-vconsole-setup.service: Deactivated successfully.1577clare # [ 2.972921] systemd[1]: Stopped Virtual Console Setup.1578clare # [ 2.974341] systemd[1]: Starting Virtual Console Setup...1579alice # [ 2.961732] (udev-worker)[95]: mtd0ro: Failed to find and pin callout binary "/nix/store/8w0qabyr98chcmr4y9hh6h6l26albldx-systemd-261.3/lib/udev/mtd_probe": No such file or directory1580alice # [ 2.967273] (udev-worker)[95]: mtd0ro: /etc/udev/rules.d/75-probe_mtd.rules:5 IMPORT{program}="mtd_probe $devnode": Failed to execute "mtd_probe /dev/mtd0ro", ignoring: No such file or directory1581clare # [ 2.990732] systemd-vconsole-setup[154]: Configuration of first virtual console was skipped, ignoring remaining ones.1582clare # [ 2.992808] systemd[1]: Finished Virtual Console Setup.1583alice # [ 2.993763] systemd[1]: systemd-vconsole-setup.service: Deactivated successfully.1584alice # [ 2.996681] systemd[1]: Stopped Virtual Console Setup.1585alice # [ 2.997225] systemd[1]: Stopping Virtual Console Setup...1586alice # [ 3.000844] systemd[1]: Starting Virtual Console Setup...1587alice # [ 3.018855] systemd-vconsole-setup[151]: Configuration of first virtual console was skipped, ignoring remaining ones.1588alice # [ 3.021032] systemd[1]: Finished Virtual Console Setup.1589alice # [ 3.313793] systemd[1]: Mounting /sysroot/nix/store...1590clare # [ 3.336072] systemd[1]: Mounting /sysroot/nix/store...1591bob # [ 3.321891] systemd[1]: Mounting /sysroot/nix/.ro-store...1592bob # [ 3.333730] systemd[1]: Mounting /sysroot/nix/.rw-store...1593bob # [ 3.336123] systemd[1]: Mounting /sysroot/run...1594bob # [ 3.348272] systemd[1]: Mounting /sysroot/tmp/shared...1595alice # [ 3.363987] systemd[1]: Mounted /sysroot/nix/store.1596alice # [ 3.366461] systemd[1]: Reached target Initrd File Systems.1597bob # [ 3.368343] systemd[1]: Mounting /sysroot/tmp/xchg...1598clare # [ 3.388484] systemd[1]: Mounted /sysroot/nix/store.1599alice # [ 3.370385] systemd[1]: Starting Find NixOS closure...1600clare # [ 3.391464] systemd[1]: Reached target Initrd File Systems.1601clare # [ 3.394654] systemd[1]: Starting Find NixOS closure...1602alice # [ 3.377320] systemd[1]: Starting Create Volatile Files and Directories in the Real Root...1603clare # [ 3.404639] systemd[1]: Starting Create Volatile Files and Directories in the Real Root...1604bob # [ 3.402194] systemd[1]: Mounted /sysroot/nix/.rw-store.1605bob # [ 3.409235] systemd[1]: Mounted /sysroot/nix/.ro-store.1606bob # [ 3.411551] systemd[1]: Mounted /sysroot/run.1607bob # [ 3.417109] systemd[1]: Mounted /sysroot/tmp/shared.1608alice # [ 3.416293] systemd[1]: Finished Create Volatile Files and Directories in the Real Root.1609bob # [ 3.424184] systemd[1]: Starting rw-sysroot-nix-store.service...1610alice # [ 3.422355] systemd[1]: sysroot-run-credentials-systemd\x2dtmpfiles\x2dsetup\x2dsysroot.service.mount: Deactivated successfully.1611bob # [ 3.426540] systemd[1]: Mounted /sysroot/tmp/xchg.1612clare # [ 3.444433] systemd[1]: Finished Create Volatile Files and Directories in the Real Root.1613clare # [ 3.447178] systemd[1]: sysroot-run-credentials-systemd\x2dtmpfiles\x2dsetup\x2dsysroot.service.mount: Deactivated successfully.1614alice # [ 3.436274] systemd[1]: Finished Find NixOS closure.1615bob # [ 3.439131] systemd[1]: rw-sysroot-nix-store.service: Deactivated successfully.1616alice # [ 3.438761] systemd[1]: Reached target Initrd Default Target.1617bob # [ 3.440340] systemd[1]: Finished rw-sysroot-nix-store.service.1618clare # [ 3.462898] systemd[1]: Finished Find NixOS closure.1619alice # [ 3.443993] systemd[1]: Starting Cleaning Up and Shutting Down Daemons...1620clare # [ 3.464747] systemd[1]: Reached target Initrd Default Target.1621clare # [ 3.467086] systemd[1]: Starting Cleaning Up and Shutting Down Daemons...1622alice # [ 3.459576] systemd[1]: Stopped target Initrd Default Target.1623alice # [ 3.461246] systemd[1]: Stopped target Basic System.1624alice # [ 3.462206] systemd[1]: Stopped target Initrd Root Device.1625alice # [ 3.463277] systemd[1]: Stopped target Path Units.1626alice # [ 3.464739] systemd[1]: systemd-ask-password-console.path: Deactivated successfully.1627alice # [ 3.468269] systemd[1]: Stopped Dispatch Password Requests to Console Directory Watch.1628alice # [ 3.469228] systemd[1]: Stopped target Slice Units.1629alice # [ 3.472138] systemd[1]: Stopped target Socket Units.1630alice # [ 3.472814] systemd[1]: Stopped target System Initialization.1631alice # [ 3.474116] systemd[1]: Stopped target Swaps.1632alice # [ 3.475320] systemd[1]: Stopped target Timer Units.1633clare # [ 3.496786] systemd[1]: Stopped target Initrd Default Target.1634alice # [ 3.477839] systemd[1]: dbus.socket: Deactivated successfully.1635clare # [ 3.498229] systemd[1]: Stopped target Basic System.1636alice # [ 3.480758] systemd[1]: Closed D-Bus System Message Bus Socket.1637clare # [ 3.500248] systemd[1]: Stopped target Initrd Root Device.1638alice # [ 3.481926] systemd[1]: initrd-find-nixos-closure.service: Deactivated successfully.1639alice # [ 3.484519] systemd[1]: Stopped Find NixOS closure.1640clare # [ 3.504287] systemd[1]: Stopped target Path Units.1641clare # [ 3.505692] systemd[1]: systemd-ask-password-console.path: Deactivated successfully.1642alice # [ 3.486887] systemd[1]: Starting rw-sysroot-nix-store.service...1643clare # [ 3.507357] systemd[1]: Stopped Dispatch Password Requests to Console Directory Watch.1644alice # [ 3.490100] systemd[1]: systemd-sysctl.service: Deactivated successfully.1645alice # [ 3.491978] systemd[1]: Stopped Apply Kernel Variables.1646clare # [ 3.512087] systemd[1]: Stopped target Slice Units.1647alice # [ 3.492614] systemd[1]: systemd-modules-load.service: Deactivated successfully.1648clare # [ 3.512797] systemd[1]: Stopped target Socket Units.1649clare # [ 3.513593] systemd[1]: Stopped target System Initialization.1650alice # [ 3.494635] systemd[1]: Stopped Load Kernel Modules.1651clare # [ 3.514312] systemd[1]: Stopped target Swaps.1652clare # [ 3.514868] systemd[1]: Stopped target Timer Units.1653alice # [ 3.495572] systemd[1]: systemd-tmpfiles-setup-sysroot.service: Deactivated successfully.1654clare # [ 3.515496] systemd[1]: dbus.socket: Deactivated successfully.1655alice # [ 3.502199] systemd[1]: Stopped Create Volatile Files and Directories in the Real Root.1656alice # [ 3.504194] systemd[1]: systemd-tmpfiles-setup.service: Deactivated successfully.1657alice # [ 3.507161] systemd[1]: Stopped Create System Files and Directories.1658alice # [ 3.507805] systemd[1]: Stopped target Local File Systems.1659clare # [ 3.527505] systemd[1]: Closed D-Bus System Message Bus Socket.1660alice # [ 3.509123] systemd[1]: Stopped target Preparation for Local File Systems.1661clare # [ 3.528556] systemd[1]: initrd-find-nixos-closure.service: Deactivated successfully.1662clare # [ 3.529642] systemd[1]: Stopped Find NixOS closure.1663alice # [ 3.510807] systemd[1]: systemd-udev-trigger.service: Deactivated successfully.1664alice # [ 3.512117] systemd[1]: Stopped Coldplug All udev Devices.1665clare # [ 3.531488] systemd[1]: Starting rw-sysroot-nix-store.service...1666clare # [ 3.532528] systemd[1]: systemd-sysctl.service: Deactivated successfully.1667alice # [ 3.513258] systemd[1]: Stopping Rule-based Manager for Device Events and Files...1668clare # [ 3.533696] systemd[1]: Stopped Apply Kernel Variables.1669clare # [ 3.534342] systemd[1]: systemd-modules-load.service: Deactivated successfully.1670clare # [ 3.535186] systemd[1]: Stopped Load Kernel Modules.1671alice # [ 3.516309] systemd[1]: systemd-vconsole-setup.service: Deactivated successfully.1672clare # [ 3.535778] systemd[1]: systemd-tmpfiles-setup-sysroot.service: Deactivated successfully.1673alice # [ 3.517006] systemd[1]: Stopped Virtual Console Setup.1674alice # [ 3.517507] systemd[1]: initrd-cleanup.service: Deactivated successfully.1675clare # [ 3.537853] systemd[1]: Stopped Create Volatile Files and Directories in the Real Root.1676alice # [ 3.518797] systemd[1]: Finished Cleaning Up and Shutting Down Daemons.1677alice # [ 3.519469] systemd[1]: systemd-udevd.service: Deactivated successfully.1678clare # [ 3.538777] systemd[1]: systemd-tmpfiles-setup.service: Deactivated successfully.1679alice # [ 3.520182] systemd[1]: Stopped Rule-based Manager for Device Events and Files.1680clare # [ 3.539613] systemd[1]: Stopped Create System Files and Directories.1681alice # [ 3.520835] systemd[1]: systemd-udevd-control.socket: Deactivated successfully.1682alice # [ 3.521462] systemd[1]: Closed udev Control Socket.1683alice # [ 3.521936] systemd[1]: Starting Cleanup udev Database...1684alice # [ 3.522431] systemd[1]: systemd-tmpfiles-setup-dev.service: Deactivated successfully.1685alice # [ 3.523124] systemd[1]: Stopped Create Static Device Nodes in /dev.1686alice # [ 3.523686] systemd[1]: systemd-tmpfiles-setup-dev-early.service: Deactivated successfully.1687clare # [ 3.545769] systemd[1]: Stopped target Local File Systems.1688clare # [ 3.546437] systemd[1]: Stopped target Preparation for Local File Systems.1689clare # [ 3.547330] systemd[1]: systemd-udev-trigger.service: Deactivated successfully.1690alice # [ 3.528189] systemd[1]: Stopped Create Static Device Nodes in /dev gracefully.1691alice # [ 3.532157] systemd[1]: kmod-static-nodes.service: Deactivated successfully.1692clare # [ 3.551639] systemd[1]: Stopped Coldplug All udev Devices.1693alice # [ 3.532920] systemd[1]: Stopped Create List of Static Device Nodes.1694alice # [ 3.533492] systemd[1]: rw-sysroot-nix-store.service: Deactivated successfully.1695alice # [ 3.534111] systemd[1]: Finished rw-sysroot-nix-store.service.1696clare # [ 3.553450] systemd[1]: Stopping Rule-based Manager for Device Events and Files...1697clare # [ 3.556350] systemd[1]: systemd-vconsole-setup.service: Deactivated successfully.1698clare # [ 3.557845] systemd[1]: Stopped Virtual Console Setup.1699clare # [ 3.558935] systemd[1]: initrd-cleanup.service: Deactivated successfully.1700clare # [ 3.562318] systemd[1]: Finished Cleaning Up and Shutting Down Daemons.1701clare # [ 3.563045] systemd[1]: systemd-udevd.service: Deactivated successfully.1702clare # [ 3.563813] systemd[1]: Stopped Rule-based Manager for Device Events and Files.1703alice # [ 3.545044] systemd[1]: initrd-udevadm-cleanup-db.service: Deactivated successfully.1704alice # [ 3.545767] systemd[1]: Finished Cleanup udev Database.1705clare # [ 3.564825] systemd[1]: systemd-udevd-control.socket: Deactivated successfully.1706clare # [ 3.566091] systemd[1]: Closed udev Control Socket.1707clare # [ 3.566613] systemd[1]: Starting Cleanup udev Database...1708clare # [ 3.567181] systemd[1]: systemd-tmpfiles-setup-dev.service: Deactivated successfully.1709clare # [ 3.567947] systemd[1]: Stopped Create Static Device Nodes in /dev.1710alice # [ 3.548776] systemd[1]: Reached target Switch Root.1711alice # [ 3.549284] systemd[1]: Starting NixOS Activation...1712clare # [ 3.571784] systemd[1]: systemd-tmpfiles-setup-dev-early.service: Deactivated successfully.1713clare # [ 3.576173] systemd[1]: Stopped Create Static Device Nodes in /dev gracefully.1714clare # [ 3.577210] systemd[1]: kmod-static-nodes.service: Deactivated successfully.1715clare # [ 3.577868] systemd[1]: Stopped Create List of Static Device Nodes.1716clare # [ 3.578448] systemd[1]: rw-sysroot-nix-store.service: Deactivated successfully.1717clare # [ 3.579091] systemd[1]: Finished rw-sysroot-nix-store.service.1718clare # [ 3.590949] systemd[1]: initrd-udevadm-cleanup-db.service: Deactivated successfully.1719clare # [ 3.595952] systemd[1]: Finished Cleanup udev Database.1720clare # [ 3.596602] systemd[1]: Reached target Switch Root.1721clare # [ 3.597169] systemd[1]: Starting NixOS Activation...1722alice # [ 3.621699] initrd-nixos-activation-start[174]: booting system configuration /nix/store/xp1n05bw700zw1i0y8x199f0abc3ij9n-nixos-system-alice-test1723clare # [ 3.668187] initrd-nixos-activation-start[177]: booting system configuration /nix/store/pz32wfgyriqbvmxl7nchdj3rlpir4vwl-nixos-system-clare-test1724alice # [ 3.649127] initrd-nixos-activation-start[174]: running activation script...1725clare # [ 3.695544] initrd-nixos-activation-start[177]: running activation script...1726alice # [ 3.866228] initrd-nixos-activation-start[197]: setting up /etc...1727clare # [ 3.905617] initrd-nixos-activation-start[200]: setting up /etc...1728alice # [ 3.951772] initrd-nixos-activation-start[197]: setting up age secrets...1729clare # [ 3.992774] initrd-nixos-activation-start[200]: setting up age secrets...1730alice # [ 4.013430] systemd[1]: initrd-nixos-activation.service: Deactivated successfully.1731alice # [ 4.015226] systemd[1]: Finished NixOS Activation.1732alice # [ 4.015996] systemd[1]: Starting Switch Root...1733clare # [ 4.050473] systemd[1]: initrd-nixos-activation.service: Deactivated successfully.1734alice # [ 4.032283] systemd[1]: Switching root.1735clare # [ 4.052164] systemd[1]: Finished NixOS Activation.1736clare # [ 4.053143] systemd[1]: Starting Switch Root...1737clare # [ 4.068436] systemd[1]: Switching root.1738alice # [ 4.200315] systemd-journald[71]: Received SIGTERM from PID 1 (systemd).1739clare # [ 4.249585] systemd-journald[71]: Received SIGTERM from PID 1 (systemd).1740bob # [ 4.319361] systemd[1]: Mounting /sysroot/nix/store...1741bob # [ 4.365242] systemd[1]: Mounted /sysroot/nix/store.1742bob # [ 4.368184] systemd[1]: Reached target Initrd File Systems.1743bob # [ 4.371618] systemd[1]: Starting Find NixOS closure...1744bob # [ 4.380343] systemd[1]: Starting Create Volatile Files and Directories in the Real Root...1745bob # [ 4.418016] systemd[1]: Finished Create Volatile Files and Directories in the Real Root.1746bob # [ 4.419846] systemd[1]: sysroot-run-credentials-systemd\x2dtmpfiles\x2dsetup\x2dsysroot.service.mount: Deactivated successfully.1747bob # [ 4.434257] systemd[1]: Finished Find NixOS closure.1748bob # [ 4.436198] systemd[1]: Reached target Initrd Default Target.1749bob # [ 4.437734] systemd[1]: Starting Cleaning Up and Shutting Down Daemons...1750bob # [ 4.466119] systemd[1]: Stopped target Initrd Default Target.1751bob # [ 4.468580] systemd[1]: Stopped target Basic System.1752bob # [ 4.472310] systemd[1]: Stopped target Initrd Root Device.1753bob # [ 4.473175] systemd[1]: Stopped target Path Units.1754bob # [ 4.473925] systemd[1]: systemd-ask-password-console.path: Deactivated successfully.1755bob # [ 4.476322] systemd[1]: Stopped Dispatch Password Requests to Console Directory Watch.1756bob # [ 4.480496] systemd[1]: Stopped target Slice Units.1757bob # [ 4.481658] systemd[1]: Stopped target Socket Units.1758bob # [ 4.484825] systemd[1]: Stopped target System Initialization.1759bob # [ 4.488901] systemd[1]: Stopped target Swaps.1760bob # [ 4.489508] systemd[1]: Stopped target Timer Units.1761bob # [ 4.490124] systemd[1]: dbus.socket: Deactivated successfully.1762bob # [ 4.490833] systemd[1]: Closed D-Bus System Message Bus Socket.1763bob # [ 4.491714] systemd[1]: initrd-find-nixos-closure.service: Deactivated successfully.1764bob # [ 4.497333] systemd[1]: Stopped Find NixOS closure.1765bob # [ 4.500981] systemd[1]: Starting rw-sysroot-nix-store.service...1766bob # [ 4.501798] systemd[1]: systemd-sysctl.service: Deactivated successfully.1767bob # [ 4.503154] systemd[1]: Stopped Apply Kernel Variables.1768bob # [ 4.503786] systemd[1]: systemd-modules-load.service: Deactivated successfully.1769bob # [ 4.509479] systemd[1]: Stopped Load Kernel Modules.1770bob # [ 4.510074] systemd[1]: systemd-tmpfiles-setup-sysroot.service: Deactivated successfully.1771bob # [ 4.511125] systemd[1]: Stopped Create Volatile Files and Directories in the Real Root.1772bob # [ 4.511964] systemd[1]: systemd-tmpfiles-setup.service: Deactivated successfully.1773bob # [ 4.520365] systemd[1]: Stopped Create System Files and Directories.1774bob # [ 4.521058] systemd[1]: Stopped target Local File Systems.1775bob # [ 4.521647] systemd[1]: Stopped target Preparation for Local File Systems.1776bob # [ 4.522350] systemd[1]: systemd-udev-trigger.service: Deactivated successfully.1777bob # [ 4.523228] systemd[1]: Stopped Coldplug All udev Devices.1778bob # [ 4.523762] systemd[1]: Stopping Rule-based Manager for Device Events and Files...1779bob # [ 4.525614] systemd[1]: systemd-vconsole-setup.service: Deactivated successfully.1780bob # [ 4.526331] systemd[1]: Stopped Virtual Console Setup.1781bob # [ 4.526855] systemd[1]: systemd-udevd.service: Deactivated successfully.1782bob # [ 4.527596] systemd[1]: Stopped Rule-based Manager for Device Events and Files.1783bob # [ 4.528401] systemd[1]: initrd-cleanup.service: Deactivated successfully.1784bob # [ 4.529036] systemd[1]: Finished Cleaning Up and Shutting Down Daemons.1785bob # [ 4.529647] systemd[1]: systemd-udevd-control.socket: Deactivated successfully.1786bob # [ 4.530318] systemd[1]: Closed udev Control Socket.1787bob # [ 4.530798] systemd[1]: Starting Cleanup udev Database...1788bob # [ 4.531443] systemd[1]: systemd-tmpfiles-setup-dev.service: Deactivated successfully.1789bob # [ 4.536243] systemd[1]: Stopped Create Static Device Nodes in /dev.1790bob # [ 4.536863] systemd[1]: systemd-tmpfiles-setup-dev-early.service: Deactivated successfully.1791bob # [ 4.540191] systemd[1]: Stopped Create Static Device Nodes in /dev gracefully.1792bob # [ 4.540945] systemd[1]: kmod-static-nodes.service: Deactivated successfully.1793bob # [ 4.541584] systemd[1]: Stopped Create List of Static Device Nodes.1794bob # [ 4.544184] systemd[1]: rw-sysroot-nix-store.service: Deactivated successfully.1795bob # [ 4.544877] systemd[1]: Finished rw-sysroot-nix-store.service.1796bob # [ 4.554293] systemd[1]: initrd-udevadm-cleanup-db.service: Deactivated successfully.1797bob # [ 4.556513] systemd[1]: Finished Cleanup udev Database.1798bob # [ 4.559168] systemd[1]: Reached target Switch Root.1799bob # [ 4.559717] systemd[1]: Starting NixOS Activation...1800bob # [ 4.637021] initrd-nixos-activation-start[175]: booting system configuration /nix/store/vd8qkla9gq340l9f8ily9my4z20h0px6-nixos-system-bob-test1801bob # [ 4.664456] initrd-nixos-activation-start[175]: running activation script...1802clare # [ 4.762738] systemd[1]: systemd 261.3 running in system mode (+PAM +AUDIT -SELINUX +APPARMOR +IMA +IPE +SMACK +SECCOMP +GCRYPT -GNUTLS +OPENSSL +ACL +BLKID +CURL +ELFUTILS +FIDO2 +IDN2 +KMOD +LIBCRYPTSETUP +LIBCRYPTSETUP_PLUGINS +LIBFDISK +PCRE2 +PWQUALITY +P11KIT +QRENCODE +TPM2 +BZIP2 +LZ4 +XZ +ZLIB +ZSTD +BPF_FRAMEWORK -BTF -XKBCOMMON +UTMP +LIBARCHIVE)1803alice # [ 4.741419] systemd[1]: systemd 261.3 running in system mode (+PAM +AUDIT -SELINUX +APPARMOR +IMA +IPE +SMACK +SECCOMP +GCRYPT -GNUTLS +OPENSSL +ACL +BLKID +CURL +ELFUTILS +FIDO2 +IDN2 +KMOD +LIBCRYPTSETUP +LIBCRYPTSETUP_PLUGINS +LIBFDISK +PCRE2 +PWQUALITY +P11KIT +QRENCODE +TPM2 +BZIP2 +LZ4 +XZ +ZLIB +ZSTD +BPF_FRAMEWORK -BTF -XKBCOMMON +UTMP +LIBARCHIVE)1804clare # [ 4.762833] systemd[1]: Detected virtualization qemu.1805alice # [ 4.741532] systemd[1]: Detected virtualization qemu.1806clare # [ 4.762893] systemd[1]: Detected architecture arm64.1807alice # [ 4.741590] systemd[1]: Detected architecture arm64.1808clare # [ 4.763026] systemd[1]: Detected first boot.1809alice # [ 4.741700] systemd[1]: Detected first boot.1810alice # [ 4.743844] systemd[1]: Initializing machine ID from random generator.1811clare # [ 4.776069] systemd[1]: Initializing machine ID from random generator.1812bob # [ 4.872891] initrd-nixos-activation-start[198]: setting up /etc...1813alice # [ 4.892212] systemd[1]: bpf-restrict-fs: LSM BPF program attached1814clare # [ 4.913957] systemd[1]: bpf-restrict-fs: LSM BPF program attached1815bob # [ 4.966495] initrd-nixos-activation-start[198]: setting up age secrets...1816clare # [ 5.043151] systemd[1]: Applying preset policy.1817alice # [ 5.028733] systemd[1]: Applying preset policy.1818bob # [ 5.044789] systemd[1]: initrd-nixos-activation.service: Deactivated successfully.1819bob # [ 5.046550] systemd[1]: Finished NixOS Activation.1820bob # [ 5.047318] systemd[1]: Starting Switch Root...1821bob # [ 5.064402] systemd[1]: Switching root.1822alice # [ 5.203169] systemd[1]: Populated /etc with preset unit settings.1823clare # [ 5.226124] systemd[1]: Populated /etc with preset unit settings.1824bob # [ 5.234007] systemd-journald[71]: Received SIGTERM from PID 1 (systemd).1825alice # [ 5.399135] systemd[1]: initrd-switch-root.service: Deactivated successfully.1826alice # [ 5.399409] systemd[1]: Stopped initrd-switch-root.service.1827alice # [ 5.401901] systemd[1]: systemd-journald.service: Scheduled restart job, restart counter is at 1.1828alice # [ 5.403190] systemd[1]: Created slice Slice /system/getty.1829alice # [ 5.404202] systemd[1]: Created slice User and Session Slice.1830alice # [ 5.407315] systemd[1]: Started Dispatch Password Requests to Console Directory Watch.1831alice # [ 5.407902] systemd[1]: Started Forward Password Requests to Wall Directory Watch.1832alice # [ 5.410349] systemd[1]: Expecting device /dev/hvc0...1833alice # [ 5.410848] systemd[1]: Expecting device /dev/ttyAMA0...1834alice # [ 5.411444] systemd[1]: Reached target Local Encrypted Volumes.1835alice # [ 5.412024] systemd[1]: Stopped target initrd-fs.target.1836alice # [ 5.414917] systemd[1]: Stopped target initrd-root-fs.target.1837alice # [ 5.415410] systemd[1]: Stopped target initrd-switch-root.target.1838alice # [ 5.415993] systemd[1]: Reached target Virtual Machines and Containers.1839alice # [ 5.418618] systemd[1]: Reached target Path Units.1840alice # [ 5.419106] systemd[1]: Reached target Remote File Systems.1841alice # [ 5.419652] systemd[1]: Reached target Slice Units.1842alice # [ 5.420205] systemd[1]: Reached target Swaps.1843alice # [ 5.424274] systemd[1]: Listening on Query the User Interactively for a Password.1844clare # [ 5.444554] systemd[1]: initrd-switch-root.service: Deactivated successfully.1845alice # [ 5.427102] systemd[1]: Listening on Process Core Dump Socket.1846clare # [ 5.446075] systemd[1]: Stopped initrd-switch-root.service.1847clare # [ 5.447894] systemd[1]: systemd-journald.service: Scheduled restart job, restart counter is at 1.1848clare # [ 5.449015] systemd[1]: Created slice Slice /system/getty.1849alice # [ 5.429206] systemd[1]: Listening on Credential Encryption/Decryption.1850alice # [ 5.430974] systemd[1]: Listening on Factory Reset Management.1851alice # [ 5.431536] systemd[1]: Listening on Hostname Service Socket.1852clare # [ 5.451885] systemd[1]: Created slice User and Session Slice.1853clare # [ 5.452470] systemd[1]: Started Dispatch Password Requests to Console Directory Watch.1854clare # [ 5.453068] systemd[1]: Started Forward Password Requests to Wall Directory Watch.1855alice # [ 5.435741] systemd[1]: Starting Journal Log Access Socket...1856clare # [ 5.456352] systemd[1]: Expecting device /dev/hvc0...1857clare # [ 5.456827] systemd[1]: Expecting device /dev/ttyAMA0...1858alice # [ 5.437874] systemd[1]: Listening on Journal Audit Socket.1859alice # [ 5.440124] systemd[1]: Listening on Console Output Muting Service Socket.1860clare # [ 5.458988] systemd[1]: Reached target Local Encrypted Volumes.1861clare # [ 5.459475] systemd[1]: Stopped target initrd-fs.target.1862clare # [ 5.460065] systemd[1]: Stopped target initrd-root-fs.target.1863clare # [ 5.460608] systemd[1]: Stopped target initrd-switch-root.target.1864clare # [ 5.461179] systemd[1]: Reached target Virtual Machines and Containers.1865alice # [ 5.442385] systemd[1]: Listening on Network Management Metrics Varlink Socket.1866alice # [ 5.443095] systemd[1]: Listening on Network Management Varlink Socket.1867clare # [ 5.464745] systemd[1]: Reached target Path Units.1868alice # [ 5.443753] systemd[1]: Listening on Network Management Netlink Socket.1869clare # [ 5.465196] systemd[1]: Reached target Remote File Systems.1870alice # [ 5.446746] systemd[1]: Listening on Userspace Out-Of-Memory (OOM) Killer Socket.1871clare # [ 5.467146] systemd[1]: Reached target Slice Units.1872clare # [ 5.467640] systemd[1]: Reached target Swaps.1873alice # [ 5.447533] systemd[1]: TPM PCR Measurements skipped, unmet condition check ConditionSecurity=measured-os1874alice # [ 5.449968] systemd[1]: Make TPM PCR Policy skipped, unmet condition check ConditionSecurity=measured-uki1875clare # [ 5.470550] systemd[1]: Listening on Query the User Interactively for a Password.1876clare # [ 5.472669] systemd[1]: Listening on Process Core Dump Socket.1877alice # [ 5.454748] systemd[1]: Listening on Disk Repartitioning Service Socket.1878clare # [ 5.475841] systemd[1]: Listening on Credential Encryption/Decryption.1879alice # [ 5.455285] systemd[1]: Listening on Resolve Monitor Varlink Socket.1880alice # [ 5.455835] systemd[1]: Listening on Resolve Service Varlink Socket.1881alice # [ 5.458432] systemd[1]: Listening on udev Control Socket.1882clare # [ 5.478208] systemd[1]: Listening on Factory Reset Management.1883alice # [ 5.458875] systemd[1]: Listening on udev Varlink Socket.1884clare # [ 5.478778] systemd[1]: Listening on Hostname Service Socket.1885alice # [ 5.461807] systemd[1]: Mounting Huge Pages File System...1886clare # [ 5.482340] systemd[1]: Starting Journal Log Access Socket...1887alice # [ 5.463848] systemd[1]: Mounting POSIX Message Queue File System...1888clare # [ 5.483635] systemd[1]: Listening on Journal Audit Socket.1889clare # [ 5.486926] systemd[1]: Listening on Console Output Muting Service Socket.1890clare # [ 5.487636] systemd[1]: Listening on Network Management Metrics Varlink Socket.1891clare # [ 5.488356] systemd[1]: Listening on Network Management Varlink Socket.1892clare # [ 5.489044] systemd[1]: Listening on Network Management Netlink Socket.1893alice # [ 5.475703] systemd[1]: Mounting Kernel Debug File System...1894clare # [ 5.493334] systemd[1]: Listening on Userspace Out-Of-Memory (OOM) Killer Socket.1895clare # [ 5.494404] systemd[1]: TPM PCR Measurements skipped, unmet condition check ConditionSecurity=measured-os1896clare # [ 5.494857] systemd[1]: Make TPM PCR Policy skipped, unmet condition check ConditionSecurity=measured-uki1897clare # [ 5.500421] systemd[1]: Listening on Disk Repartitioning Service Socket.1898clare # [ 5.500971] systemd[1]: Listening on Resolve Monitor Varlink Socket.1899alice # [ 5.482179] systemd[1]: Mounting Kernel Trace File System...1900clare # [ 5.502560] systemd[1]: Listening on Resolve Service Varlink Socket.1901clare # [ 5.503127] systemd[1]: Listening on udev Control Socket.1902clare # [ 5.503695] systemd[1]: Listening on udev Varlink Socket.1903alice # [ 5.486430] systemd[1]: Starting Create List of Static Device Nodes...1904clare # [ 5.507252] systemd[1]: Mounting Huge Pages File System...1905alice # [ 5.488982] systemd[1]: Load Kernel Module configfs skipped, unmet condition check ConditionKernelModuleLoaded=!configfs1906clare # [ 5.510161] systemd[1]: Mounting POSIX Message Queue File System...1907clare # [ 5.517544] systemd[1]: Mounting Kernel Debug File System...1908alice # [ 5.500488] systemd[1]: Mounting Kernel Configuration File System...1909alice # [ 5.501045] systemd[1]: Load Kernel Module drm skipped, unmet condition check ConditionKernelModuleLoaded=!drm1910alice # [ 5.506373] systemd[1]: Load Kernel Module efi_pstore skipped, unmet condition check ConditionKernelModuleLoaded=!efi_pstore1911alice # [ 5.506847] systemd[1]: Load Kernel Module fuse skipped, unmet condition check ConditionKernelModuleLoaded=!fuse1912clare # [ 5.530206] systemd[1]: Mounting Kernel Trace File System...1913clare # [ 5.534579] systemd[1]: Starting Create List of Static Device Nodes...1914clare # [ 5.537981] systemd[1]: Load Kernel Module configfs skipped, unmet condition check ConditionKernelModuleLoaded=!configfs1915clare # [ 5.545571] systemd[1]: Mounting Kernel Configuration File System...1916clare # [ 5.549167] systemd[1]: Load Kernel Module drm skipped, unmet condition check ConditionKernelModuleLoaded=!drm1917alice # [ 5.531365] systemd[1]: Mounting FUSE Control File System...1918alice # [ 5.531763] systemd[1]: Clear Stale Hibernate Storage Info skipped, unmet condition check ConditionPathExists=/sys/firmware/efi/efivars/HibernateLocation-8cf2644b-4b0b-428f-9387-6d876050dc671919clare # [ 5.554271] systemd[1]: Load Kernel Module efi_pstore skipped, unmet condition check ConditionKernelModuleLoaded=!efi_pstore1920clare # [ 5.554756] systemd[1]: Load Kernel Module fuse skipped, unmet condition check ConditionKernelModuleLoaded=!fuse1921clare # [ 5.569179] systemd[1]: Mounting FUSE Control File System...1922alice # [ 5.555374] systemd[1]: Starting Journal Service...1923clare # [ 5.573599] systemd[1]: Clear Stale Hibernate Storage Info skipped, unmet condition check ConditionPathExists=/sys/firmware/efi/efivars/HibernateLocation-8cf2644b-4b0b-428f-9387-6d876050dc671924alice # [ 5.563498] systemd[1]: Starting Load Kernel Modules...1925clare # [ 5.595493] systemd[1]: Starting Journal Service...1926alice # [ 5.576751] systemd[1]: Starting Userspace Out-Of-Memory (OOM) Killer...1927alice # [ 5.584668] systemd[1]: Starting Remount Root and Kernel File Systems...1928clare # [ 5.606206] systemd[1]: Starting Load Kernel Modules...1929alice # [ 5.585040] systemd[1]: Early TPM SRK Setup skipped, unmet condition check ConditionSecurity=measured-os1930alice # [ 5.603693] systemd[1]: Starting Coldplug All udev Devices...1931alice # [ 5.607358] systemd[1]: Listening on Journal Log Access Socket.1932alice # [ 5.607851] systemd[1]: Mounted Huge Pages File System.1933alice # [ 5.608217] systemd[1]: Mounted POSIX Message Queue File System.1934clare # [ 5.631421] systemd[1]: Starting Userspace Out-Of-Memory (OOM) Killer...1935alice # [ 5.619986] systemd[1]: Mounted Kernel Debug File System.1936alice # [ 5.619588] systemd[1]: Queued start job for default target Multi-User System.1937clare # [ 5.645460] systemd[1]: Starting Remount Root and Kernel File Systems...1938clare # [ 5.645860] systemd[1]: Early TPM SRK Setup skipped, unmet condition check ConditionSecurity=measured-os1939clare # [ 5.648701] systemd[1]: Starting Coldplug All udev Devices...1940alice # [ 5.624608] systemd-journald[282]: Collecting audit messages is enabled.1941alice # [ 5.629947] systemd[1]: Started Journal Service.1942clare # [ 5.652430] systemd[1]: Listening on Journal Log Access Socket.1943clare # [ 5.652836] systemd[1]: Mounted Huge Pages File System.1944alice # [ 5.628781] systemd[1]: systemd-journald.service: Deactivated successfully.1945alice # [ 5.629697] systemd-modules-load[283]: Module 'atkbd' is built in1946alice # [ 5.630418] systemd-modules-load[283]: Module 'loop' is built in1947alice # [ 5.631095] systemd[1]: Mounted Kernel Trace File System.1948alice # [ 5.631756] systemd[1]: Finished Create List of Static Device Nodes.1949alice # [ 5.636466] systemd[1]: Starting Create Static Device Nodes in /dev gracefully...1950alice # [ 5.639144] systemd[1]: Finished Load Kernel Modules.1951clare # [ 5.667084] systemd-journald[285]: Collecting audit messages is enabled.1952clare # [ 5.669409] systemd[1]: Mounted POSIX Message Queue File System.1953clare # [ 5.669866] systemd[1]: Mounted Kernel Debug File System.1954clare # [ 5.670266] systemd[1]: Mounted Kernel Trace File System.1955clare # [ 5.673110] systemd[1]: Queued start job for default target Multi-User System.1956alice # [ 5.654310] systemd[1]: Mounted Kernel Configuration File System.1957clare # [ 5.676160] systemd[1]: systemd-journald.service: Deactivated successfully.1958clare # [ 5.677121] systemd-modules-load[286]: Module 'atkbd' is built in1959clare # [ 5.677789] systemd-modules-load[286]: Module 'loop' is built in1960clare # [ 5.691761] systemd[1]: Finished Create List of Static Device Nodes.1961clare # [ 5.693073] systemd[1]: Started Journal Service.1962alice # [ 5.675465] systemd[1]: Starting Firewall...1963clare # [ 5.697552] systemd[1]: Finished Load Kernel Modules.1964alice # [ 5.678983] systemd[1]: Starting Apply Kernel Variables...1965clare # [ 5.713861] systemd[1]: Starting Firewall...1966clare # [ 5.718036] systemd[1]: Starting Apply Kernel Variables...1967clare # [ 5.725710] systemd[1]: Starting Create Static Device Nodes in /dev gracefully...1968clare # [ 5.732495] systemd[1]: Mounted Kernel Configuration File System.1969alice # [ 5.727311] systemd[1]: Mounted FUSE Control File System.1970clare # [ 5.757304] EXT4-fs (vda): re-mounted 3c03a584-5778-40ca-89c8-804af6ee8a0c.1971clare # [ 5.758373] systemd-oomd[287]: No swap; memory pressure usage will be degraded1972alice # [ 5.755496] EXT4-fs (vda): re-mounted 50142622-57b5-4dfa-9490-28a1b3a21de1.1973clare # [ 5.768955] systemd[1]: Finished Remount Root and Kernel File Systems.1974alice # [ 5.749835] systemd-oomd[284]: No swap; memory pressure usage will be degraded1975clare # [ 5.769586] systemd[1]: Listening on Disk Image Download Service Socket.1976alice # [ 5.754132] systemd[1]: Started Userspace Out-Of-Memory (OOM) Killer.1977clare # [ 5.778098] systemd[1]: Starting Flush Journal to Persistent Storage...1978clare # [ 5.778721] systemd[1]: Platform Persistent Storage Archival skipped, unmet condition check ConditionDirectoryNotEmpty=/sys/fs/pstore1979alice # [ 5.761302] systemd[1]: Finished Remount Root and Kernel File Systems.1980alice # [ 5.761958] systemd[1]: Listening on Disk Image Download Service Socket.1981alice # [ 5.764631] systemd[1]: Starting Flush Journal to Persistent Storage...1982alice # [ 5.765264] systemd[1]: Platform Persistent Storage Archival skipped, unmet condition check ConditionDirectoryNotEmpty=/sys/fs/pstore1983clare # [ 5.785974] systemd[1]: Starting Load/Save OS Random Seed...1984clare # [ 5.786539] systemd[1]: TPM SRK Setup skipped, unmet condition check ConditionSecurity=measured-os1985clare # [ 5.787285] systemd[1]: Started Userspace Out-Of-Memory (OOM) Killer.1986bob # [ 5.771117] systemd[1]: systemd 261.3 running in system mode (+PAM +AUDIT -SELINUX +APPARMOR +IMA +IPE +SMACK +SECCOMP +GCRYPT -GNUTLS +OPENSSL +ACL +BLKID +CURL +ELFUTILS +FIDO2 +IDN2 +KMOD +LIBCRYPTSETUP +LIBCRYPTSETUP_PLUGINS +LIBFDISK +PCRE2 +PWQUALITY +P11KIT +QRENCODE +TPM2 +BZIP2 +LZ4 +XZ +ZLIB +ZSTD +BPF_FRAMEWORK -BTF -XKBCOMMON +UTMP +LIBARCHIVE)1987bob # [ 5.771210] systemd[1]: Detected virtualization qemu.1988bob # [ 5.771268] systemd[1]: Detected architecture arm64.1989bob # [ 5.771401] systemd[1]: Detected first boot.1990alice # [ 5.775284] systemd[1]: Starting Load/Save OS Random Seed...1991alice # [ 5.775850] systemd[1]: TPM SRK Setup skipped, unmet condition check ConditionSecurity=measured-os1992bob # [ 5.784882] systemd[1]: Initializing machine ID from random generator.1993clare # [ 5.810833] systemd[1]: Mounted FUSE Control File System.1994clare # [ 5.852297] systemd-journald[285]: Received client request to flush runtime journal.1995alice # [ 5.833239] systemd-journald[282]: Received client request to flush runtime journal.1996alice # [ 5.872350] systemd[1]: Finished Load/Save OS Random Seed.1997alice # [ 5.873020] systemd[1]: Reached target First Boot Complete.1998alice # [ 5.873579] systemd[1]: Finished Create Static Device Nodes in /dev gracefully.1999alice # [ 5.874227] systemd[1]: Starting Create Static Device Nodes in /dev...2000alice # [ 5.874806] systemd[1]: Finished Apply Kernel Variables.2001alice # [ 5.875298] systemd[1]: Starting Network Name Resolution...2002clare # [ 5.896539] systemd[1]: Finished Load/Save OS Random Seed.2003clare # [ 5.897155] systemd[1]: Reached target First Boot Complete.2004clare # [ 5.897675] systemd[1]: Finished Apply Kernel Variables.2005clare # [ 5.898157] systemd[1]: Starting Network Name Resolution...2006clare # [ 5.908812] systemd[1]: Finished Flush Journal to Persistent Storage.2007alice # [ 5.890071] systemd[1]: Finished Flush Journal to Persistent Storage.2008clare # [ 5.932336] systemd[1]: Finished Create Static Device Nodes in /dev gracefully.2009bob # [ 5.923756] systemd[1]: bpf-restrict-fs: LSM BPF program attached2010clare # [ 5.937650] systemd[1]: Starting Create Static Device Nodes in /dev...2011bob # [ 6.004855] systemd[1]: Applying preset policy.2012alice # [ 6.017361] systemd-resolved[312]: Positive Trust Anchors:2013alice # [ 6.017983] systemd-resolved[312]: . IN DS 20326 8 2 e06d44b80b8f1d39a95c0b0d7c65d08458e880409bbc683457104237c7f8ec8d2014alice # [ 6.018871] systemd-resolved[312]: . IN DS 38696 8 2 683d2d0acb8c9b712a1948b27f741219298d0a450d612c483af444a4c0fb2b162015alice # [ 6.019750] systemd-resolved[312]: Negative trust anchors: home.arpa 10.in-addr.arpa 16.172.in-addr.arpa 17.172.in-addr.arpa 18.172.in-addr.arpa 19.172.in-addr.arpa 20.172.in-addr.arpa 21.172.in-addr.arpa 22.172.in-addr.arpa 23.172.in-addr.arpa 24.172.in-addr.arpa 25.172.in-addr.arpa 26.172.in-addr.arpa 27.172.in-addr.arpa 28.172.in-addr.arpa 29.172.in-addr.arpa 30.172.in-addr.arpa 31.172.in-addr.arpa 170.0.0.192.in-addr.arpa 171.0.0.192.in-addr.arpa 168.192.in-addr.arpa d.f.ip6.arpa ipv4only.arpa resolver.arpa corp home internal intranet lan local private test2016clare # [ 6.046637] systemd-resolved[312]: Positive Trust Anchors:2017clare # [ 6.047203] systemd-resolved[312]: . IN DS 20326 8 2 e06d44b80b8f1d39a95c0b0d7c65d08458e880409bbc683457104237c7f8ec8d2018clare # [ 6.052311] systemd-resolved[312]: . IN DS 38696 8 2 683d2d0acb8c9b712a1948b27f741219298d0a450d612c483af444a4c0fb2b162019clare # [ 6.053220] systemd-resolved[312]: Negative trust anchors: home.arpa 10.in-addr.arpa 16.172.in-addr.arpa 17.172.in-addr.arpa 18.172.in-addr.arpa 19.172.in-addr.arpa 20.172.in-addr.arpa 21.172.in-addr.arpa 22.172.in-addr.arpa 23.172.in-addr.arpa 24.172.in-addr.arpa 25.172.in-addr.arpa 26.172.in-addr.arpa 27.172.in-addr.arpa 28.172.in-addr.arpa 29.172.in-addr.arpa 30.172.in-addr.arpa 31.172.in-addr.arpa 170.0.0.192.in-addr.arpa 171.0.0.192.in-addr.arpa 168.192.in-addr.arpa d.f.ip6.arpa ipv4only.arpa resolver.arpa corp home internal intranet lan local private test2020alice # [ 6.105765] systemd[1]: Finished Create Static Device Nodes in /dev.2021alice # [ 6.106414] systemd[1]: Reached target Preparation for Local File Systems.2022alice # [ 6.108376] systemd[1]: Starting Rule-based Manager for Device Events and Files...2023bob # [ 6.166110] systemd[1]: Populated /etc with preset unit settings.2024clare # [ 6.221728] systemd[1]: Finished Create Static Device Nodes in /dev.2025clare # [ 6.222386] systemd[1]: Reached target Preparation for Local File Systems.2026clare # [ 6.224444] systemd[1]: Starting Rule-based Manager for Device Events and Files...2027alice # [ 6.212404] systemd-resolved[312]: Using system hostname 'alice'.2028alice # [ 6.215318] systemd[1]: Started Network Name Resolution.2029clare # [ 6.240244] systemd-resolved[312]: Using system hostname 'clare'.2030alice # [ 6.223899] systemd[1]: Finished Coldplug All udev Devices.2031clare # [ 6.248701] systemd[1]: Started Network Name Resolution.2032alice # [ 6.244329] systemd-udevd[321]: Using default interface naming scheme 'v261'.2033clare # [ 6.266128] systemd[1]: Finished Coldplug All udev Devices.2034clare # [ 6.300827] systemd-udevd[326]: Using default interface naming scheme 'v261'.2035alice # [ 6.296161] systemd[1]: Started Rule-based Manager for Device Events and Files.2036clare # [ 6.352485] systemd[1]: Started Rule-based Manager for Device Events and Files.2037bob # [ 6.380272] systemd[1]: initrd-switch-root.service: Deactivated successfully.2038bob # [ 6.380961] systemd[1]: Stopped initrd-switch-root.service.2039bob # [ 6.384120] systemd[1]: systemd-journald.service: Scheduled restart job, restart counter is at 1.2040bob # [ 6.386477] systemd[1]: Created slice Slice /system/getty.2041bob # [ 6.387505] systemd[1]: Created slice User and Session Slice.2042bob # [ 6.388114] systemd[1]: Started Dispatch Password Requests to Console Directory Watch.2043bob # [ 6.388743] systemd[1]: Started Forward Password Requests to Wall Directory Watch.2044bob # [ 6.389325] systemd[1]: Expecting device /dev/hvc0...2045bob # [ 6.392922] systemd[1]: Expecting device /dev/ttyAMA0...2046bob # [ 6.394430] systemd[1]: Reached target Local Encrypted Volumes.2047bob # [ 6.394948] systemd[1]: Stopped target initrd-fs.target.2048bob # [ 6.395513] systemd[1]: Stopped target initrd-root-fs.target.2049bob # [ 6.396083] systemd[1]: Stopped target initrd-switch-root.target.2050bob # [ 6.396680] systemd[1]: Reached target Virtual Machines and Containers.2051bob # [ 6.397269] systemd[1]: Reached target Path Units.2052bob # [ 6.401088] systemd[1]: Reached target Remote File Systems.2053alice # [ 6.394514] systemd[1]: Mounting /run/wrappers...2054bob # [ 6.402669] systemd[1]: Reached target Slice Units.2055bob # [ 6.403175] systemd[1]: Reached target Swaps.2056bob # [ 6.405293] systemd[1]: Listening on Query the User Interactively for a Password.2057bob # [ 6.409325] systemd[1]: Listening on Process Core Dump Socket.2058bob # [ 6.411454] systemd[1]: Listening on Credential Encryption/Decryption.2059bob # [ 6.413240] systemd[1]: Listening on Factory Reset Management.2060alice # [ 6.405083] systemd[1]: Load Kernel Module configfs skipped, unmet condition check ConditionKernelModuleLoaded=!configfs2061bob # [ 6.415448] systemd[1]: Listening on Hostname Service Socket.2062bob # [ 6.418643] systemd[1]: Starting Journal Log Access Socket...2063bob # [ 6.419903] systemd[1]: Listening on Journal Audit Socket.2064bob # [ 6.423227] systemd[1]: Listening on Console Output Muting Service Socket.2065bob # [ 6.423913] systemd[1]: Listening on Network Management Metrics Varlink Socket.2066bob # [ 6.424654] systemd[1]: Listening on Network Management Varlink Socket.2067bob # [ 6.425360] systemd[1]: Listening on Network Management Netlink Socket.2068bob # [ 6.429111] systemd[1]: Listening on Userspace Out-Of-Memory (OOM) Killer Socket.2069clare # [ 6.440308] systemd[1]: Mounting /run/wrappers...2070bob # [ 6.431093] systemd[1]: TPM PCR Measurements skipped, unmet condition check ConditionSecurity=measured-os2071bob # [ 6.432248] systemd[1]: Make TPM PCR Policy skipped, unmet condition check ConditionSecurity=measured-uki2072bob # [ 6.437257] systemd[1]: Listening on Disk Repartitioning Service Socket.2073bob # [ 6.438387] systemd[1]: Listening on Resolve Monitor Varlink Socket.2074bob # [ 6.438953] systemd[1]: Listening on Resolve Service Varlink Socket.2075bob # [ 6.439523] systemd[1]: Listening on udev Control Socket.2076bob # [ 6.440097] systemd[1]: Listening on udev Varlink Socket.2077alice # [ 6.432147] systemd[1]: Load Kernel Module fuse skipped, unmet condition check ConditionKernelModuleLoaded=!fuse2078bob # [ 6.444485] systemd[1]: Mounting Huge Pages File System...2079bob # [ 6.446869] systemd[1]: Mounting POSIX Message Queue File System...2080alice # [ 6.442915] systemd[1]: Mounted /run/wrappers.2081alice # [ 6.444101] systemd[1]: Reached target Local File Systems.2082alice # [ 6.447779] systemd[1]: Listening on Boot Loader Control Service Socket.2083bob # [ 6.457835] systemd[1]: Mounting Kernel Debug File System...2084alice # [ 6.451864] systemd[1]: Starting register-nix-paths.service...2085alice # [ 6.456370] systemd[1]: Starting Create SUID/SGID Wrappers...2086alice # [ 6.456952] systemd[1]: Update Boot Loader Random Seed skipped, no trigger condition checks were met.2087clare # [ 6.475770] systemd[1]: Load Kernel Module configfs skipped, unmet condition check ConditionKernelModuleLoaded=!configfs2088bob # [ 6.465815] systemd[1]: Mounting Kernel Trace File System...2089bob # [ 6.475986] systemd[1]: Starting Create List of Static Device Nodes...2090bob # [ 6.476453] systemd[1]: Load Kernel Module configfs skipped, unmet condition check ConditionKernelModuleLoaded=!configfs2091alice # [ 6.468349] systemd[1]: Starting Save Transient machine-id to Disk...2092clare # [ 6.488198] systemd[1]: Mounted /run/wrappers.2093clare # [ 6.489299] systemd[1]: Reached target Local File Systems.2094clare # [ 6.493163] systemd[1]: Listening on Boot Loader Control Service Socket.2095clare # [ 6.498073] systemd[1]: Starting register-nix-paths.service...2096bob # [ 6.488632] systemd[1]: Mounting Kernel Configuration File System...2097bob # [ 6.489141] systemd[1]: Load Kernel Module drm skipped, unmet condition check ConditionKernelModuleLoaded=!drm2098clare # [ 6.503253] systemd[1]: Starting Create SUID/SGID Wrappers...2099bob # [ 6.492318] systemd[1]: Load Kernel Module efi_pstore skipped, unmet condition check ConditionKernelModuleLoaded=!efi_pstore2100bob # [ 6.493156] systemd[1]: Load Kernel Module fuse skipped, unmet condition check ConditionKernelModuleLoaded=!fuse2101clare # [ 6.504111] systemd[1]: Update Boot Loader Random Seed skipped, no trigger condition checks were met.2102clare # [ 6.507467] systemd[1]: Starting Save Transient machine-id to Disk...2103alice # [ 6.491444] systemd[1]: Starting Create System Files and Directories...2104clare # [ 6.516081] systemd[1]: Starting Create System Files and Directories...2105clare # [ 6.516689] systemd[1]: Load Kernel Module fuse skipped, unmet condition check ConditionKernelModuleLoaded=!fuse2106bob # [ 6.510561] systemd[1]: Mounting FUSE Control File System...2107bob # [ 6.512884] systemd[1]: Clear Stale Hibernate Storage Info skipped, unmet condition check ConditionPathExists=/sys/firmware/efi/efivars/HibernateLocation-8cf2644b-4b0b-428f-9387-6d876050dc672108bob # [ 6.537911] systemd[1]: Starting Journal Service...2109bob # [ 6.551402] systemd[1]: Starting Load Kernel Modules...2110bob # [ 6.565059] systemd[1]: Starting Userspace Out-Of-Memory (OOM) Killer...2111bob # [ 6.578993] systemd[1]: Starting Remount Root and Kernel File Systems...2112bob # [ 6.579383] systemd[1]: Early TPM SRK Setup skipped, unmet condition check ConditionSecurity=measured-os2113bob # [ 6.597669] systemd[1]: Starting Coldplug All udev Devices...2114bob # [ 6.599619] systemd[1]: Listening on Journal Log Access Socket.2115bob # [ 6.600025] systemd[1]: Mounted Huge Pages File System.2116bob # [ 6.600465] systemd[1]: Mounted POSIX Message Queue File System.2117bob # [ 6.600824] systemd[1]: Mounted Kernel Debug File System.2118alice # [ 6.594088] systemd[1]: etc-machine\x2did.mount: Deactivated successfully.2119bob # [ 6.601166] systemd[1]: Mounted Kernel Trace File System.2120clare # [ 6.617184] systemd[1]: etc-machine\x2did.mount: Deactivated successfully.2121alice # [ 6.600539] systemd[1]: Finished Save Transient machine-id to Disk.2122bob # [ 6.611650] systemd[1]: Finished Create List of Static Device Nodes.2123bob # [ 6.612213] systemd[1]: Mounted Kernel Configuration File System.2124clare # [ 6.626605] systemd[1]: Finished Save Transient machine-id to Disk.2125bob # [ 6.629929] systemd-journald[291]: Collecting audit messages is enabled.2126bob # [ 6.636564] systemd[1]: Starting Create Static Device Nodes in /dev gracefully...2127bob # [ 6.636975] systemd[1]: Queued start job for default target Multi-User System.2128bob # [ 6.647798] systemd[1]: Started Journal Service.2129alice # [ 6.639393] systemd[1]: Finished Create System Files and Directories.2130bob # [ 6.642732] systemd[1]: systemd-journald.service: Deactivated successfully.2131alice # [ 6.645469] systemd[1]: Starting Rebuild Journal Catalog...2132bob # [ 6.649596] systemd-modules-load[292]: Module 'atkbd' is built in2133bob # [ 6.652294] systemd-modules-load[292]: Module 'loop' is built in2134alice # [ 6.652128] systemd[1]: Starting Record System Boot/Shutdown in UTMP...2135clare # [ 6.682566] systemd[1]: Finished Create System Files and Directories.2136bob # [ 6.667735] systemd[1]: Finished Load Kernel Modules.2137bob # [ 6.673963] systemd[1]: Starting Firewall...2138clare # [ 6.692218] systemd[1]: Starting Rebuild Journal Catalog...2139bob # [ 6.681673] systemd[1]: Starting Apply Kernel Variables...2140clare # [ 6.700463] systemd[1]: Starting Record System Boot/Shutdown in UTMP...2141bob # [ 6.693781] EXT4-fs (vda): re-mounted dceae672-475b-4dbd-a218-398d406d48e0.2142bob # [ 6.699539] systemd[1]: Mounted FUSE Control File System.2143bob # [ 6.704988] systemd[1]: Finished Remount Root and Kernel File Systems.2144bob # [ 6.706919] systemd[1]: Listening on Disk Image Download Service Socket.2145alice # [ 6.707322] systemd[1]: Condition check resulted in /dev/hvc0 being skipped.2146bob # [ 6.715078] systemd[1]: Starting Flush Journal to Persistent Storage...2147bob # [ 6.715713] systemd[1]: Platform Persistent Storage Archival skipped, unmet condition check ConditionDirectoryNotEmpty=/sys/fs/pstore2148bob # [ 6.740373] systemd[1]: Starting Load/Save OS Random Seed...2149bob # [ 6.740970] systemd[1]: TPM SRK Setup skipped, unmet condition check ConditionSecurity=measured-os2150bob # [ 6.750543] systemd-oomd[293]: No swap; memory pressure usage will be degraded2151alice # [ 6.754000] systemd[1]: Finished Record System Boot/Shutdown in UTMP.2152bob # [ 6.763492] systemd[1]: Started Userspace Out-Of-Memory (OOM) Killer.2153alice # [ 6.789822] systemd[1]: Finished Rebuild Journal Catalog.2154clare # [ 6.810416] systemd[1]: Finished Record System Boot/Shutdown in UTMP.2155clare # [ 6.812602] systemd[1]: Condition check resulted in /dev/hvc0 being skipped.2156alice # [ 6.796577] systemd[1]: Starting Update is Completed...2157bob # [ 6.806022] systemd-journald[291]: Received client request to flush runtime journal.2158alice # [ 6.814242] systemd[1]: Condition check resulted in /dev/ttyAMA0 being skipped.2159clare # [ 6.844967] systemd[1]: Finished Rebuild Journal Catalog.2160clare # [ 6.851398] systemd[1]: Starting Update is Completed...2161clare # [ 6.870792] systemd[1]: Condition check resulted in /dev/ttyAMA0 being skipped.2162alice # [ 6.860794] systemd[1]: Finished Update is Completed.2163bob # [ 6.890645] systemd[1]: Finished Create Static Device Nodes in /dev gracefully.2164bob # [ 6.891498] systemd[1]: Starting Create Static Device Nodes in /dev...2165clare # [ 6.916466] systemd[1]: Finished Update is Completed.2166bob # [ 6.900309] systemd[1]: Finished Load/Save OS Random Seed.2167bob # [ 6.900856] systemd[1]: Reached target First Boot Complete.2168bob # [ 6.901382] systemd[1]: Finished Apply Kernel Variables.2169bob # [ 6.901861] systemd[1]: Starting Network Name Resolution...2170bob # [ 6.902349] systemd[1]: Finished Flush Journal to Persistent Storage.2171alice # [ 7.050030] (udev-worker)[346]: Network interface NamePolicy= disabled on kernel command line.2172alice # [ 7.055187] (udev-worker)[350]: Network interface NamePolicy= disabled on kernel command line.2173bob # [ 7.065135] systemd-resolved[321]: Positive Trust Anchors:2174bob # [ 7.065732] systemd-resolved[321]: . IN DS 20326 8 2 e06d44b80b8f1d39a95c0b0d7c65d08458e880409bbc683457104237c7f8ec8d2175bob # [ 7.066574] systemd-resolved[321]: . IN DS 38696 8 2 683d2d0acb8c9b712a1948b27f741219298d0a450d612c483af444a4c0fb2b162176bob # [ 7.067453] systemd-resolved[321]: Negative trust anchors: home.arpa 10.in-addr.arpa 16.172.in-addr.arpa 17.172.in-addr.arpa 18.172.in-addr.arpa 19.172.in-addr.arpa 20.172.in-addr.arpa 21.172.in-addr.arpa 22.172.in-addr.arpa 23.172.in-addr.arpa 24.172.in-addr.arpa 25.172.in-addr.arpa 26.172.in-addr.arpa 27.172.in-addr.arpa 28.172.in-addr.arpa 29.172.in-addr.arpa 30.172.in-addr.arpa 31.172.in-addr.arpa 170.0.0.192.in-addr.arpa 171.0.0.192.in-addr.arpa 168.192.in-addr.arpa d.f.ip6.arpa ipv4only.arpa resolver.arpa corp home internal intranet lan local private test2177clare # [ 7.098986] (udev-worker)[346]: Network interface NamePolicy= disabled on kernel command line.2178clare # [ 7.102677] (udev-worker)[347]: Network interface NamePolicy= disabled on kernel command line.2179bob # [ 7.122283] systemd[1]: Finished Create Static Device Nodes in /dev.2180bob # [ 7.122945] systemd[1]: Reached target Preparation for Local File Systems.2181bob # [ 7.125082] systemd[1]: Starting Rule-based Manager for Device Events and Files...2182bob # [ 7.224244] systemd[1]: Finished Coldplug All udev Devices.2183bob # [ 7.234268] systemd-resolved[321]: Using system hostname 'bob'.2184bob # [ 7.238239] systemd[1]: Started Network Name Resolution.2185bob # [ 7.251289] systemd-udevd[330]: Using default interface naming scheme 'v261'.2186alice # [ 7.302625] mousedev: PS/2 mouse device common for all mice2187bob # [ 7.304461] systemd[1]: Started Rule-based Manager for Device Events and Files.2188clare # [ 7.367590] mousedev: PS/2 mouse device common for all mice2189alice # [ 7.361507] systemd[1]: Finished register-nix-paths.service.2190alice # [ 7.369936] systemd[1]: suid-sgid-wrappers.service: Deactivated successfully.2191alice # [ 7.372695] systemd[1]: Finished Create SUID/SGID Wrappers.2192alice # [ 7.373271] systemd[1]: Reached target System Initialization.2193alice # [ 7.373817] systemd[1]: Started Discard unused filesystem blocks once a week.2194alice # [ 7.374433] systemd[1]: Started Daily Cleanup of Temporary Directories.2195alice # [ 7.375013] systemd[1]: Reached target Timer Units.2196bob # [ 7.377441] systemd[1]: Mounting /run/wrappers...2197alice # [ 7.383532] systemd[1]: Listening on D-Bus System Message Bus Socket.2198alice # [ 7.384686] systemd[1]: Listening on Nix Daemon Socket.2199alice # [ 7.387700] systemd[1]: Listening on Virtual Machine and Container Registration Service Socket.2200alice # [ 7.392803] systemd[1]: Reached target Socket Units.2201alice # [ 7.393312] systemd[1]: Reached target Basic System.2202alice # [ 7.393804] systemd[1]: Started backdoor.service.2203alice # [ 7.394268] systemd[1]: Starting Import lastlog data into lastlog2 database...2204alice # [ 7.394899] systemd[1]: Starting Name Service Cache Daemon (nsncd)...2205clare # [ 7.422162] systemd[1]: suid-sgid-wrappers.service: Deactivated successfully.2206clare # [ 7.425072] systemd[1]: Finished Create SUID/SGID Wrappers.2207alice # [ 7.407048] systemd[1]: Starting Post-Boot Actions...2208clare # [ 7.426852] systemd[1]: Finished register-nix-paths.service.2209clare # [ 7.427407] systemd[1]: Reached target System Initialization.2210clare # [ 7.427937] systemd[1]: Started Discard unused filesystem blocks once a week.2211clare # [ 7.433464] systemd[1]: Started Daily Cleanup of Temporary Directories.2212clare # [ 7.434673] systemd[1]: Reached target Timer Units.2213clare # [ 7.435134] systemd[1]: Listening on D-Bus System Message Bus Socket.2214clare # [ 7.441940] systemd[1]: Listening on harmonia binary cache socket.2215clare # [ 7.442546] systemd[1]: Listening on Nix Daemon Socket.2216clare # [ 7.443034] systemd[1]: Listening on Virtual Machine and Container Registration Service Socket.2217clare # [ 7.443746] systemd[1]: Reached target Socket Units.2218alice # [ 7.424441] systemd[1]: Started Reset console on configuration changes.2219bob # [ 7.426682] systemd[1]: Mounted /run/wrappers.2220bob # [ 7.427535] systemd[1]: Reached target Local File Systems.2221clare # [ 7.448694] systemd[1]: Reached target Basic System.2222clare # [ 7.449192] systemd[1]: Started backdoor.service.2223bob # [ 7.432195] systemd[1]: Listening on Boot Loader Control Service Socket.2224clare # [ 7.452332] systemd[1]: Starting Import lastlog data into lastlog2 database...2225bob # [ 7.435298] systemd[1]: Starting register-nix-paths.service...2226clare # [ 7.457320] systemd[1]: Starting Name Service Cache Daemon (nsncd)...2227bob # [ 7.439357] systemd[1]: Starting Create SUID/SGID Wrappers...2228bob # [ 7.439917] systemd[1]: Update Boot Loader Random Seed skipped, no trigger condition checks were met.2229bob # [ 7.444813] systemd[1]: Starting Save Transient machine-id to Disk...2230clare # [ 7.473940] systemd[1]: Starting Post-Boot Actions...2231alice # [ 7.459775] systemd[1]: Starting D-Bus System Message Bus...2232bob # [ 7.463971] systemd[1]: Starting Create System Files and Directories...2233bob # [ 7.465960] systemd[1]: Load Kernel Module configfs skipped, unmet condition check ConditionKernelModuleLoaded=!configfs2234bob # [ 7.477516] systemd[1]: Load Kernel Module fuse skipped, unmet condition check ConditionKernelModuleLoaded=!fuse2235clare # [ 7.501512] systemd[1]: Started Reset console on configuration changes.2236clare # [ 7.536120] systemd[1]: Starting D-Bus System Message Bus...2237alice # [ 7.531471] systemd[1]: Finished Post-Boot Actions.2238alice # connecting to host...2239bob # [ 7.550460] systemd[1]: etc-machine\x2did.mount: Deactivated successfully.2240bob # [ 7.555328] systemd[1]: Finished Save Transient machine-id to Disk.2241alice # [ 7.558679] systemd[1]: Started Name Service Cache Daemon (nsncd).2242alice # [ 7.561371] systemd[1]: Reached target Host and Network Name Lookups.2243alice # [ 7.561998] systemd[1]: Reached target User and Group Name Lookups.2244alice # [ 7.571058] nsncd[473]: Oct 07 05:20:55.387 INFO started, config: Config { ignored_request_types: {}, worker_count: 8, handoff_timeout: 10s }, path: "/var/run/nscd/socket"2245clare # [ 7.598445] systemd[1]: Started Name Service Cache Daemon (nsncd).2246alice # [ 7.581515] systemd[1]: Starting User Login Management...2247clare # [ 7.601695] nsncd[476]: Oct 07 05:20:55.438 INFO started, config: Config { ignored_request_types: {}, worker_count: 8, handoff_timeout: 10s }, path: "/var/run/nscd/socket"2248clare # [ 7.610871] systemd[1]: Reached target Host and Network Name Lookups.2249clare # [ 7.611559] systemd[1]: Reached target User and Group Name Lookups.2250clare # connecting to host...2251clare # [ 7.624538] systemd[1]: Starting User Login Management...2252clare # [ 7.626918] systemd[1]: Finished Post-Boot Actions.2253alice # [ 7.615775] systemd[1]: Finished Import lastlog data into lastlog2 database.2254bob # [ 7.638745] systemd[1]: Finished Create System Files and Directories.2255clare # [ 7.662400] systemd[1]: Finished Import lastlog data into lastlog2 database.2256bob # [ 7.646293] systemd[1]: Starting Rebuild Journal Catalog...2257bob # [ 7.652339] systemd[1]: Starting Record System Boot/Shutdown in UTMP...2258alice # [ 7.692596] dbus-broker-launch[479]: Looking up NSS user entry for 'systemd-timesync'...2259alice # [ 7.706976] dbus-broker-launch[479]: NSS returned no entry for 'systemd-timesync'2260alice # [ 7.707683] dbus-broker-launch[479]: Invalid user-name in /nix/store/1hq4agwd3q80lb722fxb35wmyzlnrk6q-system-path/share/dbus-1/system.d/org.freedesktop.timesync1.conf +16: user="systemd-timesync"2261alice # [ 7.718013] systemd-logind[498]: Watching system buttons on /dev/input/event1 (QEMU QEMU USB Keyboard)2262alice # [ 7.720928] systemd-logind[498]: Watching system buttons on /dev/input/event0 (gpio-keys)2263alice # [ 7.723910] systemd-logind[498]: New seat seat0.2264alice # [ 7.732693] systemd[1]: Started User Login Management.2265alice # [ 7.733200] systemd[1]: Starting linger-users.service...2266clare # [ 7.755293] dbus-broker-launch[482]: Looking up NSS user entry for 'systemd-timesync'...2267clare # [ 7.760454] systemd-logind[504]: Watching system buttons on /dev/input/event1 (QEMU QEMU USB Keyboard)2268bob # [ 7.748102] systemd[1]: Finished Record System Boot/Shutdown in UTMP.2269clare # [ 7.764326] systemd-logind[504]: Watching system buttons on /dev/input/event0 (gpio-keys)2270clare # [ 7.767233] systemd-logind[504]: New seat seat0.2271clare # [ 7.771466] systemd[1]: Started User Login Management.2272alice # [ 7.752077] systemd[1]: Started D-Bus System Message Bus.2273clare # [ 7.773800] systemd[1]: Starting linger-users.service...2274clare # [ 7.776476] dbus-broker-launch[482]: NSS returned no entry for 'systemd-timesync'2275clare # [ 7.780649] dbus-broker-launch[482]: Invalid user-name in /nix/store/16ww7sz86177drhs17kx18vlbhkmib53-system-path/share/dbus-1/system.d/org.freedesktop.timesync1.conf +16: user="systemd-timesync"2276alice # [ 7.784399] dbus-broker-launch[479]: Ready2277bob # [ 7.786523] systemd[1]: Condition check resulted in /dev/hvc0 being skipped.2278clare # [ 7.807080] systemd[1]: Started D-Bus System Message Bus.2279bob # [ 7.792445] systemd[1]: Finished Rebuild Journal Catalog.2280bob # [ 7.796603] systemd[1]: Starting Update is Completed...2281alice # [ 7.800319] systemd[1]: linger-users.service: Deactivated successfully.2282alice # [ 7.803460] systemd[1]: Finished linger-users.service.2283clare # [ 7.842204] systemd[1]: linger-users.service: Deactivated successfully.2284clare # [ 7.845292] systemd[1]: Finished linger-users.service.2285clare # [ 7.847143] dbus-broker-launch[482]: Ready2286bob # [ 7.851409] systemd[1]: Condition check resulted in /dev/ttyAMA0 being skipped.2287alice # [ 7.874784] systemd[1]: Finished Firewall.2288alice # [ 7.876559] systemd[1]: Reached target Preparation for Network.2289alice # [ 7.879844] systemd[1]: Listening on Network Management Resolve Hook Socket.2290alice # [ 7.883431] systemd[1]: Starting Network Management...2291bob # [ 7.900250] systemd[1]: Finished Update is Completed.2292clare # [ 7.928354] systemd[1]: Finished Firewall.2293clare # [ 7.929807] systemd[1]: Reached target Preparation for Network.2294clare # [ 7.933122] systemd[1]: Listening on Network Management Resolve Hook Socket.2295clare # [ 7.936957] systemd[1]: Starting Network Management...2296alice # [ 8.067114] cfg80211: Loading compiled-in X.509 certificates for regulatory database2297bob # [ 8.083878] (udev-worker)[354]: Network interface NamePolicy= disabled on kernel command line.2298clare # [ 8.108605] cfg80211: Loading compiled-in X.509 certificates for regulatory database2299bob # [ 8.087551] (udev-worker)[360]: Network interface NamePolicy= disabled on kernel command line.2300alice # [ 8.112436] Loaded X.509 cert 'sforshee: 00b28ddf47aef9cea7'2301alice # [ 8.112951] Loaded X.509 cert 'wens: 61c038651aabdcf94bd0ac7ff06c7248db18c600'2302alice # [ 8.115359] faux_driver regulatory: Direct firmware load for regulatory.db failed with error -22303alice # [ 8.115744] cfg80211: failed to load regulatory.db2304clare # [ 8.141375] Loaded X.509 cert 'sforshee: 00b28ddf47aef9cea7'2305clare # [ 8.141911] Loaded X.509 cert 'wens: 61c038651aabdcf94bd0ac7ff06c7248db18c600'2306clare # [ 8.143242] faux_driver regulatory: Direct firmware load for regulatory.db failed with error -22307clare # [ 8.143623] cfg80211: failed to load regulatory.db2308alice # [ 8.136807] systemd-networkd[538]: lo: Link UP2309alice # [ 8.138276] systemd-networkd[538]: lo: Gained carrier2310clare # [ 8.162966] systemd-networkd[544]: lo: Link UP2311clare # [ 8.164733] systemd-networkd[544]: lo: Gained carrier2312alice # [ 8.147694] systemd[1]: Started Network Management.2313alice # [ 8.148247] systemd[1]: Reached target Network.2314alice # [ 8.148652] systemd[1]: Starting Enable Persistent Storage in systemd-networkd...2315clare # [ 8.171344] systemd[1]: Started Network Management.2316alice # [ 8.153793] systemd[1]: Starting Permit User Sessions...2317clare # [ 8.175588] systemd-networkd[544]: eth0: Configuring with /etc/systemd/network/99-ethernet-default-dhcp.network.2318alice # [ 8.156574] systemd-networkd[538]: eth0: Configuring with /etc/systemd/network/99-ethernet-default-dhcp.network.2319clare # [ 8.179023] systemd[1]: Reached target Network.2320clare # [ 8.181507] systemd-networkd[544]: eth1: Found matching .network file, based on potentially unpredictable interface name: /etc/systemd/network/40-eth1.network2321clare # [ 8.182826] systemd-networkd[544]: eth1: Configuring with /etc/systemd/network/40-eth1.network.2322alice # [ 8.163367] systemd-networkd[538]: eth1: Found matching .network file, based on potentially unpredictable interface name: /etc/systemd/network/40-eth1.network2323alice # [ 8.166998] systemd-networkd[538]: eth1: Configuring with /etc/systemd/network/40-eth1.network.2324alice # [ 8.167725] systemd-networkd[538]: eth0: Link UP2325clare # [ 8.189913] systemd[1]: Starting Enable Persistent Storage in systemd-networkd...2326clare # [ 8.190576] systemd-networkd[544]: eth0: Link UP2327clare # [ 8.190986] systemd-networkd[544]: eth0: Gained carrier2328clare # [ 8.191424] systemd[1]: Starting Permit User Sessions...2329alice # [ 8.174525] systemd-networkd[538]: eth0: Gained carrier2330alice # [ 8.175012] systemd-networkd[538]: eth1: Link UP2331alice # [ 8.175412] systemd-networkd[538]: eth1: Gained carrier2332alice # [ 8.175872] systemd-networkd[538]: eth1: Found matching .network file, based on potentially unpredictable interface name: /etc/systemd/network/40-eth1.network2333clare # [ 8.199130] systemd-networkd[544]: eth1: Link UP2334clare # [ 8.199597] systemd-networkd[544]: eth1: Gained carrier2335clare # [ 8.202418] systemd-networkd[544]: eth1: Found matching .network file, based on potentially unpredictable interface name: /etc/systemd/network/40-eth1.network2336alice # [ 8.188732] systemd-networkd[538]: eth0: DHCPv4 address 10.0.2.15/24, gateway 10.0.2.2 acquired from 10.0.2.22337clare # [ 8.210183] systemd-networkd[544]: eth0: DHCPv4 address 10.0.2.15/24, gateway 10.0.2.2 acquired from 10.0.2.22338alice # [ 8.226127] systemd[1]: Finished Permit User Sessions.2339alice # [ 8.234469] systemd[1]: Started Getty on tty1.2340alice # [ 8.234999] systemd[1]: Reached target Login Prompts.2341alice # [ 8.235458] systemd[1]: Reached target Multi-User System.2342clare # [ 8.256497] systemd[1]: Finished Permit User Sessions.2343clare # [ 8.262205] systemd[1]: Started Getty on tty1.2344clare # [ 8.264285] systemd[1]: Reached target Login Prompts.2345alice # [ 8.246553] systemd[1]: Finished Enable Persistent Storage in systemd-networkd.2346clare # [ 8.266277] systemd[1]: Reached target Multi-User System.2347alice # [ 8.248672] systemd[1]: Startup finished in 723ms (kernel) + 3.586s (initrd) + 3.936s (userspace) = 8.247s.2348clare # [ 8.271002] systemd[1]: Finished Enable Persistent Storage in systemd-networkd.2349clare # [ 8.281255] systemd[1]: Startup finished in 736ms (kernel) + 3.592s (initrd) + 3.951s (userspace) = 8.280s.2350bob # [ 8.285267] systemd[1]: suid-sgid-wrappers.service: Deactivated successfully.2351bob # [ 8.285985] systemd[1]: Finished Create SUID/SGID Wrappers.2352bob # [ 8.298433] systemd[1]: Finished register-nix-paths.service.2353bob # [ 8.300510] systemd[1]: Reached target System Initialization.2354bob # [ 8.301099] systemd[1]: Started Discard unused filesystem blocks once a week.2355bob # [ 8.301719] systemd[1]: Started Daily Cleanup of Temporary Directories.2356bob # [ 8.302295] systemd[1]: Reached target Timer Units.2357bob # [ 8.308799] systemd[1]: Listening on D-Bus System Message Bus Socket.2358bob # [ 8.309420] systemd[1]: Listening on Nix Daemon Socket.2359bob # [ 8.309909] systemd[1]: Listening on Virtual Machine and Container Registration Service Socket.2360bob # [ 8.310645] systemd[1]: Reached target Socket Units.2361bob # [ 8.311115] systemd[1]: Reached target Basic System.2362bob # [ 8.311565] systemd[1]: Started backdoor.service.2363bob # [ 8.318983] systemd[1]: Starting Import lastlog data into lastlog2 database...2364bob # [ 8.319623] systemd[1]: Starting Name Service Cache Daemon (nsncd)...2365bob # [ 8.335319] mousedev: PS/2 mouse device common for all mice2366bob # [ 8.336354] systemd[1]: Starting Post-Boot Actions...2367bob # [ 8.348655] systemd[1]: Started Reset console on configuration changes.2368bob # [ 8.386759] systemd[1]: Starting D-Bus System Message Bus...2369alice # [ 8.400827] input: QEMU Virtio Keyboard as /devices/platform/4010000000.pcie/pci0000:00/0000:00:06.0/virtio5/input/input32370bob # [ 8.437527] systemd[1]: Finished Post-Boot Actions.2371clare # [ 8.475464] input: QEMU Virtio Keyboard as /devices/platform/4010000000.pcie/pci0000:00/0000:00:06.0/virtio5/input/input32372bob # connecting to host...2373bob # [ 8.486774] systemd[1]: Started Name Service Cache Daemon (nsncd).2374bob # [ 8.487398] systemd[1]: Reached target Host and Network Name Lookups.2375bob # [ 8.487932] systemd[1]: Reached target User and Group Name Lookups.2376bob # [ 8.493486] nsncd[476]: Oct 07 05:20:56.317 INFO started, config: Config { ignored_request_types: {}, worker_count: 8, handoff_timeout: 10s }, path: "/var/run/nscd/socket"2377bob # [ 8.508185] systemd[1]: Starting User Login Management...2378bob: Guest shell says: b'Spawning backdoor root shell...\n'2379bob # [ 8.540498] systemd[1]: Finished Import lastlog data into lastlog2 database.2380bob: connected to guest root shell2381bob: (connecting took 8.89 seconds)2382bob: (finished: waiting for the VM to finish booting, in 8.89 seconds)2383bob # [ 8.619328] dbus-broker-launch[483]: Looking up NSS user entry for 'systemd-timesync'...2384bob # [ 8.627815] systemd-logind[503]: Watching system buttons on /dev/input/event1 (QEMU QEMU USB Keyboard)2385bob # [ 8.634888] systemd-logind[503]: Watching system buttons on /dev/input/event0 (gpio-keys)2386bob # [ 8.637204] systemd-logind[503]: New seat seat0.2387bob # [ 8.641987] systemd[1]: Started User Login Management.2388bob # [ 8.646968] systemd[1]: Starting linger-users.service...2389bob # [ 8.647956] dbus-broker-launch[483]: NSS returned no entry for 'systemd-timesync'2390bob # [ 8.656731] dbus-broker-launch[483]: Invalid user-name in /nix/store/c19cl6mgva5ipipijba7s905fspc9svi-system-path/share/dbus-1/system.d/org.freedesktop.timesync1.conf +16: user="systemd-timesync"2391bob # [ 8.682303] systemd[1]: Started D-Bus System Message Bus.2392alice # [ 8.691692] systemd[1]: Listening on Load/Save RF Kill Switch Status /dev/rfkill Watch.2393alice # [ 8.693943] systemd[1]: Starting Virtual Console Setup...2394alice # [ 8.726031] systemd-logind[498]: Watching system buttons on /dev/input/event3 (QEMU Virtio Keyboard)2395bob # [ 8.731126] dbus-broker-launch[483]: Ready2396bob # [ 8.734889] systemd[1]: linger-users.service: Deactivated successfully.2397bob # [ 8.736924] systemd[1]: Finished linger-users.service.2398clare # [ 8.776396] systemd[1]: Listening on Load/Save RF Kill Switch Status /dev/rfkill Watch.2399clare # [ 8.783665] systemd[1]: Starting Virtual Console Setup...2400clare # [ 8.809503] systemd-logind[504]: Watching system buttons on /dev/input/event3 (QEMU Virtio Keyboard)2401alice # [ 8.798802] systemd-vconsole-setup[556]: Configuration of first virtual console was skipped, ignoring remaining ones.2402alice # [ 8.801913] systemd[1]: Finished Virtual Console Setup.2403clare # [ 8.889799] systemd-vconsole-setup[562]: Configuration of first virtual console was skipped, ignoring remaining ones.2404clare # [ 8.892436] systemd[1]: Finished Virtual Console Setup.2405bob # [ 8.893957] systemd[1]: Finished Firewall.2406bob # [ 8.895514] systemd[1]: Reached target Preparation for Network.2407bob # [ 8.899159] systemd[1]: Listening on Network Management Resolve Hook Socket.2408bob # [ 8.902723] systemd[1]: Starting Network Management...2409bob # [ 9.072819] cfg80211: Loading compiled-in X.509 certificates for regulatory database2410bob # [ 9.119262] Loaded X.509 cert 'sforshee: 00b28ddf47aef9cea7'2411bob # [ 9.119786] Loaded X.509 cert 'wens: 61c038651aabdcf94bd0ac7ff06c7248db18c600'2412bob # [ 9.120827] faux_driver regulatory: Direct firmware load for regulatory.db failed with error -22413bob # [ 9.121202] cfg80211: failed to load regulatory.db2414bob # [ 9.141492] systemd-networkd[558]: lo: Link UP2415bob # [ 9.143198] systemd-networkd[558]: lo: Gained carrier2416bob # [ 9.151590] systemd[1]: Started Network Management.2417bob # [ 9.153584] systemd[1]: Reached target Network.2418bob # [ 9.154021] systemd[1]: Reached target Network is Online.2419bob # [ 9.154467] systemd[1]: Starting ncps binary cache proxy service...2420bob # [ 9.160596] systemd-networkd[558]: eth1: Found matching .network file, based on potentially unpredictable interface name: /etc/systemd/network/40-eth1.network2421bob # [ 9.161915] systemd-networkd[558]: eth1: Configuring with /etc/systemd/network/40-eth1.network.2422bob # [ 9.162615] systemd[1]: Starting Enable Persistent Storage in systemd-networkd...2423bob # [ 9.175298] systemd-networkd[558]: eth0: Configuring with /etc/systemd/network/99-ethernet-default-dhcp.network.2424bob # [ 9.177309] systemd-networkd[558]: eth1: Link UP2425bob # [ 9.177745] systemd-networkd[558]: eth1: Gained carrier2426bob # [ 9.178175] systemd-networkd[558]: eth1: Found matching .network file, based on potentially unpredictable interface name: /etc/systemd/network/40-eth1.network2427bob # [ 9.179468] systemd-networkd[558]: eth0: Link UP2428bob # [ 9.179866] systemd-networkd[558]: eth0: Gained carrier2429bob # [ 9.189277] systemd-networkd[558]: eth0: DHCPv4 address 10.0.2.15/24, gateway 10.0.2.2 acquired from 10.0.2.22430bob # [ 9.192278] systemd[1]: Starting Permit User Sessions...2431clare # [ 9.250519] systemd-networkd[544]: eth1: Gained IPv6LL2432bob # [ 9.264218] systemd[1]: Finished Permit User Sessions.2433bob # [ 9.274112] systemd[1]: Started Getty on tty1.2434bob # [ 9.283155] systemd[1]: Reached target Login Prompts.2435bob # [ 9.283664] systemd[1]: Finished Enable Persistent Storage in systemd-networkd.2436bob # [ 9.305722] ncps-pre-start[565]: /nix/store/z27dji5sjdkkdpzjlm37nq6d5cwbgl8i-ncps-0.9.4/bin/dbmate-ncps up2437alice # [ 9.409509] systemd-networkd[538]: eth1: Gained IPv6LL2438clare # [ 9.442168] systemd-networkd[544]: eth0: Gained IPv6LL2439alice # [ 9.474747] systemd-networkd[538]: eth0: Gained IPv6LL2440bob # [ 9.519676] ncps-pre-start[580]: Creating: /var/lib/ncps/db/db.sqlite2441bob # [ 9.557411] input: QEMU Virtio Keyboard as /devices/platform/4010000000.pcie/pci0000:00/0000:00:06.0/virtio5/input/input32442bob # [ 9.567909] ncps-pre-start[580]: Applying: 20241210054814_create-narinfos-table.sql2443bob # [ 9.581932] ncps-pre-start[580]: Applied: 20241210054814_create-narinfos-table.sql in 14.00044ms2444bob # [ 9.582927] ncps-pre-start[580]: Applying: 20241210054829_create-nars-table.sql2445bob # [ 9.592232] ncps-pre-start[580]: Applied: 20241210054829_create-nars-table.sql in 10.2818ms2446bob # [ 9.593166] ncps-pre-start[580]: Applying: 20241213014846_add-query-to-nars-table.sql2447bob # [ 9.601121] ncps-pre-start[580]: Applied: 20241213014846_add-query-to-nars-table.sql in 8.877ms2448bob # [ 9.602480] ncps-pre-start[580]: Applying: 20251230224159_add-cascade-to-nars-fk.sql2449bob # [ 9.610630] ncps-pre-start[580]: Applied: 20251230224159_add-cascade-to-nars-fk.sql in 9.49664ms2450bob # [ 9.612145] ncps-pre-start[580]: Applying: 20260101000000_add-config-table.sql2451bob # [ 9.624192] ncps-pre-start[580]: Applied: 20260101000000_add-config-table.sql in 13.54808ms2452bob # [ 9.625155] ncps-pre-start[580]: Applying: 20260105025735_remove-redundant-indexes.sql2453bob # [ 9.636209] ncps-pre-start[580]: Applied: 20260105025735_remove-redundant-indexes.sql in 12.00072ms2454bob # [ 9.637160] ncps-pre-start[580]: Applying: 20260105030513_support_shared_nars_between_narinfos.sql2455bob # [ 9.646711] ncps-pre-start[580]: Applied: 20260105030513_support_shared_nars_between_narinfos.sql in 10.49316ms2456bob # [ 9.648866] ncps-pre-start[580]: Applying: 20260117195000_add_narinfo_de_normalized.sql2457bob # [ 9.657712] ncps-pre-start[580]: Applied: 20260117195000_add_narinfo_de_normalized.sql in 11.04792ms2458bob # [ 9.658553] ncps-pre-start[580]: Applying: 20260127223000_allow_multiple_nar_representations.sql2459bob # [ 9.668191] ncps-pre-start[580]: Applied: 20260127223000_allow_multiple_nar_representations.sql in 8.71476ms2460bob # [ 9.670467] ncps-pre-start[580]: Applying: 20260131021850_add_chunks.sql2461bob # [ 9.684202] ncps-pre-start[580]: Applied: 20260131021850_add_chunks.sql in 15.98416ms2462bob # [ 9.685085] ncps-pre-start[580]: Applying: 20260205063651_add_total_chunks_to_nar_files.sql2463bob # [ 9.695611] ncps-pre-start[580]: Applied: 20260205063651_add_total_chunks_to_nar_files.sql in 11.39804ms2464bob # [ 9.696693] ncps-pre-start[580]: Applying: 20260217071237_add_chunking_started_at_to_nar_files.sql2465bob # [ 9.710242] ncps-pre-start[580]: Applied: 20260217071237_add_chunking_started_at_to_nar_files.sql in 14.62488ms2466bob # [ 9.712285] ncps-pre-start[580]: Applying: 20260301000000_add_verified_at_to_nar_files.sql2467bob # [ 9.717902] ncps-pre-start[580]: Applied: 20260301000000_add_verified_at_to_nar_files.sql in 7.32104ms2468bob # [ 9.864290] systemd[1]: Started ncps binary cache proxy service.2469bob # [ 9.868811] systemd[1]: Reached target Multi-User System.2470bob # [ 9.869732] systemd[1]: Startup finished in 719ms (kernel) + 4.581s (initrd) + 4.565s (userspace) = 9.865s.2471bob: (finished: waiting for unit ncps, in 10.18 seconds)2472bob: must succeed: systemctl status ncps2473bob: (finished: must succeed: systemctl status ncps, in 0.07 seconds)2474clare: waiting for unit harmonia.socket2475clare: waiting for the VM to finish booting2476clare: Guest shell says: b'Spawning backdoor root shell...\n'2477clare: connected to guest root shell2478clare: (connecting took 0.00 seconds)2479clare: (finished: waiting for the VM to finish booting, in 0.00 seconds)2480clare: (finished: waiting for unit harmonia.socket, in 0.05 seconds)2481alice: waiting for success: curl bob:8502/nix-cache-info2482alice: waiting for the VM to finish booting2483alice: Guest shell says: b'Spawning backdoor root shell...\n'2484alice: connected to guest root shell2485alice: (connecting took 0.00 seconds)2486alice: (finished: waiting for the VM to finish booting, in 0.00 seconds)2487bob # [ 10.035140] systemd[1]: Listening on Load/Save RF Kill Switch Status /dev/rfkill Watch.2488bob # [ 10.044180] systemd[1]: Starting Virtual Console Setup...2489bob # [ 10.067941] systemd[1]: systemd-vconsole-setup.service: Deactivated successfully.2490bob # [ 10.071778] systemd[1]: Stopped Virtual Console Setup.2491bob # [ 10.075667] systemd[1]: Starting Virtual Console Setup...2492bob # [ 10.079253] systemd-logind[503]: Watching system buttons on /dev/input/event3 (QEMU Virtio Keyboard)2493bob # [ 10.202530] 70ya7n6byxa3fdhyxaknx3sks1f7mmwi-ncps-wrapper[587]: {"level":"info","log_level":"info","time":"2026-10-07T05:20:58Z","message":"logger created"}2494bob # [ 10.204076] 70ya7n6byxa3fdhyxaknx3sks1f7mmwi-ncps-wrapper[587]: {"level":"info","xz-binary-path":"/nix/store/csrwf31hprwghnbyiglxa3p787lgrl67-xz-5.8.4-bin/bin/xz","time":"2026-10-07T05:20:58Z","message":"Using xz binary for xz decompression"}2495bob # [ 10.218371] 70ya7n6byxa3fdhyxaknx3sks1f7mmwi-ncps-wrapper[587]: {"level":"info","cmd":"serve","operation":"auto-max-procs","time":"2026-10-07T05:20:58Z","message":"maxprocs: Leaving GOMAXPROCS=1: CPU quota undefined"}2496bob # [ 10.225212] 70ya7n6byxa3fdhyxaknx3sks1f7mmwi-ncps-wrapper[587]: {"level":"info","cmd":"serve","time":"2026-10-07T05:20:58Z","message":"using local locks (single-instance mode)"}2497bob # [ 10.231533] 70ya7n6byxa3fdhyxaknx3sks1f7mmwi-ncps-wrapper[587]: {"level":"info","cmd":"serve","otel-enabled":false,"otel-grpc-url":"","time":"2026-10-07T05:20:58Z","message":"setting up tracer provider to discard traces"}2498bob # [ 10.235127] 70ya7n6byxa3fdhyxaknx3sks1f7mmwi-ncps-wrapper[587]: {"level":"info","cmd":"serve","otel-enabled":false,"otel-grpc-url":"","time":"2026-10-07T05:20:58Z","message":"setting up meter provider to discard metrics"}2499bob # [ 10.239838] 70ya7n6byxa3fdhyxaknx3sks1f7mmwi-ncps-wrapper[587]: {"level":"info","cmd":"serve","otel-enabled":false,"otel-grpc-url":"","time":"2026-10-07T05:20:58Z","message":"setting up logger provider to discard logs"}2500bob # [ 10.243413] 70ya7n6byxa3fdhyxaknx3sks1f7mmwi-ncps-wrapper[587]: {"level":"info","cmd":"serve","endpoint":"otlp.ncps.dev:443","time":"2026-10-07T05:20:58Z","message":"Reporting anonymous metrics to the project maintainers"}2501bob # [ 10.246679] 70ya7n6byxa3fdhyxaknx3sks1f7mmwi-ncps-wrapper[587]: {"level":"warn","cmd":"serve","error":"open /var/empty/.netrc: no such file or directory","time":"2026-10-07T05:20:58Z","message":"failed to parse netrc file, proceeding without netrc authentication"}2502bob # [ 10.249392] 70ya7n6byxa3fdhyxaknx3sks1f7mmwi-ncps-wrapper[587]: {"level":"info","cmd":"serve","path":"/var/lib/ncps","time":"2026-10-07T05:20:58Z","message":"using local storage"}2503bob # [ 10.272828] systemd-networkd[558]: eth1: Gained IPv6LL2504clare # [ 10.296928] systemd[1]: Starting harmonia binary cache service...2505bob # [ 10.302348] systemd-vconsole-setup[605]: Configuration of first virtual console was skipped, ignoring remaining ones.2506bob # [ 10.304834] systemd[1]: Finished Virtual Console Setup.2507clare # [ 10.436209] harmonia-cache[569]: 2026-10-07T05:20:58.272675Z INFO harmonia_cache: listening on inherited fd 3 (Ok([::]:5000))2508clare # [ 10.441656] harmonia-cache[569]: 2026-10-07T05:20:58.276949Z INFO actix_server::builder: starting 4 workers2509clare # [ 10.451403] harmonia-cache[569]: 2026-10-07T05:20:58.281810Z INFO harmonia_cache::systemd: systemd watchdog enabled, pinging every 7.5s2510clare # [ 10.455171] harmonia-cache[569]: 2026-10-07T05:20:58.281891Z INFO actix_server::server: Actix runtime found; starting in Actix runtime2511clare # [ 10.458910] harmonia-cache[569]: 2026-10-07T05:20:58.281997Z INFO actix_server::server: starting service: "actix-web-service-[::]:5000", workers: 4, listening on: [::]:50002512clare # [ 10.463395] systemd[1]: Started harmonia binary cache service.2513bob # [ 10.469165] 70ya7n6byxa3fdhyxaknx3sks1f7mmwi-ncps-wrapper[587]: {"level":"info","cmd":"serve","upstream":"clare.clan","time":"2026-10-07T05:20:58Z","message":"upstream became healthy and is now available for requests"}2514bob # [ 10.475527] 70ya7n6byxa3fdhyxaknx3sks1f7mmwi-ncps-wrapper[587]: {"level":"info","cmd":"serve","server_addr":":8502","time":"2026-10-07T05:20:58Z","message":"Server started"}2515bob # [ 10.688945] systemd-networkd[558]: eth0: Gained IPv6LL2516alice # % Total % Received % Xferd Average Speed Time Time Time Current2517alice # Dload Upload Total Spent Left Speed2518bob # [ 11.141697] 70ya7n6byxa3fdhyxaknx3sks1f7mmwi-ncps-wrapper[587]: {"level":"info","cmd":"serve","method":"GET","request_uri":"/nix-cache-info","from":"[2001:db8:1::1]:50256","trace_id":"67f3a8ee8d155b2a2dd8c9515b2f24dc","span_id":"6434b2450d3ed0ee","status":200,"elapsed":0.06868,"bytes":50,"time":"2026-10-07T05:20:58Z","message":"handled request"}2519alice # 0 0 0 0 0 0 0 0 00:01 0100 50 100 50 0 0 47 0 00:01 00:01 0100 50 100 50 0 0 46 0 00:01 00:01 0100 50 100 50 0 0 46 0 00:01 00:01 02520alice: (finished: waiting for success: curl bob:8502/nix-cache-info, in 1.14 seconds)2521bob: waiting for success: curl clare:5000/nix-cache-info2522bob # % Total % Received % Xferd Average Speed Time Time Time Current2523bob # Dload Upload T[ 11.270053] 70ya7n6byxa3fdhyxaknx3sks1f7mmwi-ncps-wrapper[587]: 2026/10/07 05:20:59 Post "https://otlp.ncps.dev:443/v1/logs": dial tcp: lookup otlp.ncps.dev: no such host2524bob # otal Spent Left Speed2525bob # 0 0 0 0 0 0 0 0 0100 51 100 51 0 0 1814 0 0100 51 100 51 0 0 1682 0 0100 51 100 51 0 0 1565 0 02526bob: (finished: waiting for success: curl clare:5000/nix-cache-info, in 0.11 seconds)2527clare: waiting for unit harmonia2528clare: (finished: waiting for unit harmonia, in 0.07 seconds)2529clare: must succeed: systemctl status harmonia2530clare: (finished: must succeed: systemctl status harmonia, in 0.03 seconds)2531clare: must succeed: nix-build --expr '2532 builtins.derivation {2533 name = "hi";2534 builder = "/bin/sh";2535 args = [ "-c" "echo hi > $out" ];2536 system = "aarch64-linux";2537 }2538' 2>&125392540clare # [ 11.785768] systemd-resolved[312]: Using degraded feature set UDP instead of UDP+EDNS0 for DNS server 10.0.2.3.2541clare # [ 12.360817] systemd-resolved[312]: Using degraded feature set TCP instead of UDP for DNS server 10.0.2.3.2542clare # [ 12.364782] systemd-resolved[312]: Using degraded feature set UDP instead of TCP for DNS server 10.0.2.3.2543clare # [ 13.624719] systemd-resolved[312]: Using degraded feature set TCP instead of UDP for DNS server 10.0.2.3.2544clare # [ 13.628677] systemd-resolved[312]: Using degraded feature set UDP instead of TCP for DNS server 10.0.2.3.2545clare # [ 16.056908] systemd-resolved[312]: Using degraded feature set TCP instead of UDP for DNS server 10.0.2.3.2546clare # [ 16.060432] systemd-resolved[312]: Using degraded feature set UDP instead of TCP for DNS server 10.0.2.3.2547clare: (finished: must succeed: nix-build --expr '2548 builtins.derivation {2549 name = "hi";2550 builder = "/bin/sh";2551 args = [ "-c" "echo hi > $out" ];2552 system = "aarch64-linux";2553 }2554' 2>&12555, in 4.77 seconds)2556alice: must succeed: nix-build --expr '2557 builtins.derivation {2558 name = "hi";2559 builder = "/bin/sh";2560 args = [ "-c" "echo hi > $out" ];2561 system = "aarch64-linux";2562 }2563' 2>&125642565bob # [ 16.263671] 70ya7n6byxa3fdhyxaknx3sks1f7mmwi-ncps-wrapper[587]: {"level":"info","cmd":"serve","method":"GET","request_uri":"/nix-cache-info","from":"[2001:db8:1::1]:36090","trace_id":"cf950d5130e4b46a2f53c108413dacd5","span_id":"c274164cf77d473c","status":200,"elapsed":0.03032,"bytes":50,"time":"2026-10-07T05:21:04Z","message":"handled request"}2566alice # [ 16.555026] systemd-resolved[312]: Using degraded feature set UDP instead of UDP+EDNS0 for DNS server 10.0.2.3.2567alice # [ 16.559486] systemd-resolved[312]: Using degraded feature set TCP instead of UDP for DNS server 10.0.2.3.2568alice # [ 16.563442] systemd-resolved[312]: Using degraded feature set UDP instead of TCP for DNS server 10.0.2.3.2569alice # [ 17.172332] systemd-resolved[312]: Using degraded feature set TCP instead of UDP for DNS server 10.0.2.3.2570alice # [ 17.176423] systemd-resolved[312]: Using degraded feature set UDP instead of TCP for DNS server 10.0.2.3.2571alice # [ 18.361471] systemd-resolved[312]: Using degraded feature set TCP instead of UDP for DNS server 10.0.2.3.2572alice # [ 18.365432] systemd-resolved[312]: Using degraded feature set UDP instead of TCP for DNS server 10.0.2.3.2573alice # [ 20.852299] systemd-resolved[312]: Using degraded feature set TCP instead of UDP for DNS server 10.0.2.3.2574alice # [ 20.855598] systemd-resolved[312]: Using degraded feature set UDP instead of TCP for DNS server 10.0.2.3.2575bob # [ 20.864984] 70ya7n6byxa3fdhyxaknx3sks1f7mmwi-ncps-wrapper[587]: {"level":"info","cmd":"serve","method":"GET","request_uri":"/dijrshgr0dg50jkvhxs7kzxmvz9zci8p.narinfo","from":"[2001:db8:1::1]:36090","trace_id":"eadc1e028167a3647cd6177c6c22e68f","span_id":"3318ab9adea05b29","narinfo_hash":"dijrshgr0dg50jkvhxs7kzxmvz9zci8p","narinfo_hash":"dijrshgr0dg50jkvhxs7kzxmvz9zci8p","narinfo_hash":"dijrshgr0dg50jkvhxs7kzxmvz9zci8p","narinfo_url":"http://clare.clan:5000/dijrshgr0dg50jkvhxs7kzxmvz9zci8p.narinfo","upstream_url":"http://clare.clan:5000","time":"2026-10-07T05:21:08Z","message":"download the narinfo from upstream"}2576bob # [ 20.896190] 70ya7n6byxa3fdhyxaknx3sks1f7mmwi-ncps-wrapper[587]: {"level":"info","cmd":"serve","method":"GET","request_uri":"/dijrshgr0dg50jkvhxs7kzxmvz9zci8p.narinfo","from":"[2001:db8:1::1]:36090","trace_id":"eadc1e028167a3647cd6177c6c22e68f","span_id":"3318ab9adea05b29","narinfo_hash":"dijrshgr0dg50jkvhxs7kzxmvz9zci8p","narinfo_hash":"dijrshgr0dg50jkvhxs7kzxmvz9zci8p","nar_url":"nar/1xmr8jicvzszfzpz46g37mlpvbzjl2wpwvl2b05psipssyp1sm8h.nar?hash=dijrshgr0dg50jkvhxs7kzxmvz9zci8p","time":"2026-10-07T05:21:08Z","message":"downloading the nar from upstream"}2577bob # [ 20.907538] 70ya7n6byxa3fdhyxaknx3sks1f7mmwi-ncps-wrapper[587]: {"level":"info","cmd":"serve","method":"GET","request_uri":"/dijrshgr0dg50jkvhxs7kzxmvz9zci8p.narinfo","from":"[2001:db8:1::1]:36090","trace_id":"eadc1e028167a3647cd6177c6c22e68f","span_id":"3318ab9adea05b29","narinfo_hash":"dijrshgr0dg50jkvhxs7kzxmvz9zci8p","narinfo_hash":"dijrshgr0dg50jkvhxs7kzxmvz9zci8p","nar_url":"nar/1xmr8jicvzszfzpz46g37mlpvbzjl2wpwvl2b05psipssyp1sm8h.nar?hash=dijrshgr0dg50jkvhxs7kzxmvz9zci8p","nar_hash":"1xmr8jicvzszfzpz46g37mlpvbzjl2wpwvl2b05psipssyp1sm8h","nar_compression":"none","nar_query":"hash=dijrshgr0dg50jkvhxs7kzxmvz9zci8p","nar_url":"http://clare.clan:5000/nar/1xmr8jicvzszfzpz46g37mlpvbzjl2wpwvl2b05psipssyp1sm8h.nar?hash=dijrshgr0dg50jkvhxs7kzxmvz9zci8p","upstream_url":"http://clare.clan:5000","nar_hash":"1xmr8jicvzszfzpz46g37mlpvbzjl2wpwvl2b05psipssyp1sm8h","nar_compression":"none","nar_query":"hash=dijrshgr0dg50jkvhxs7kzxmvz9zci8p","time":"2026-10-07T05:21:08Z","message":"download the nar from upstream"}2578bob # [ 20.936211] 70ya7n6byxa3fdhyxaknx3sks1f7mmwi-ncps-wrapper[587]: {"level":"info","cmd":"serve","method":"GET","request_uri":"/dijrshgr0dg50jkvhxs7kzxmvz9zci8p.narinfo","from":"[2001:db8:1::1]:36090","trace_id":"eadc1e028167a3647cd6177c6c22e68f","span_id":"3318ab9adea05b29","narinfo_hash":"dijrshgr0dg50jkvhxs7kzxmvz9zci8p","narinfo_hash":"dijrshgr0dg50jkvhxs7kzxmvz9zci8p","nar_url":"nar/1xmr8jicvzszfzpz46g37mlpvbzjl2wpwvl2b05psipssyp1sm8h.nar?hash=dijrshgr0dg50jkvhxs7kzxmvz9zci8p","elapsed":37.96608,"time":"2026-10-07T05:21:08Z","message":"download of nar complete"}2579bob # [ 20.960081] 70ya7n6byxa3fdhyxaknx3sks1f7mmwi-ncps-wrapper[587]: {"level":"info","cmd":"serve","method":"GET","request_uri":"/dijrshgr0dg50jkvhxs7kzxmvz9zci8p.narinfo","from":"[2001:db8:1::1]:36090","trace_id":"eadc1e028167a3647cd6177c6c22e68f","span_id":"3318ab9adea05b29","narinfo_hash":"dijrshgr0dg50jkvhxs7kzxmvz9zci8p","narinfo_hash":"dijrshgr0dg50jkvhxs7kzxmvz9zci8p","nar_url":"nar/1xmr8jicvzszfzpz46g37mlpvbzjl2wpwvl2b05psipssyp1sm8h.nar?hash=dijrshgr0dg50jkvhxs7kzxmvz9zci8p","time":"2026-10-07T05:21:08Z","message":"storing narinfo and nar_file record in the database"}2580bob # [ 20.968480] 70ya7n6byxa3fdhyxaknx3sks1f7mmwi-ncps-wrapper[587]: {"level":"info","cmd":"serve","method":"GET","request_uri":"/dijrshgr0dg50jkvhxs7kzxmvz9zci8p.narinfo","from":"[2001:db8:1::1]:36090","trace_id":"eadc1e028167a3647cd6177c6c22e68f","span_id":"3318ab9adea05b29","narinfo_hash":"dijrshgr0dg50jkvhxs7kzxmvz9zci8p","narinfo_hash":"dijrshgr0dg50jkvhxs7kzxmvz9zci8p","nar_url":"nar/1xmr8jicvzszfzpz46g37mlpvbzjl2wpwvl2b05psipssyp1sm8h.nar?hash=dijrshgr0dg50jkvhxs7kzxmvz9zci8p","elapsed":93.63072,"time":"2026-10-07T05:21:08Z","message":"download of narinfo complete"}2581bob # [ 20.977248] 70ya7n6byxa3fdhyxaknx3sks1f7mmwi-ncps-wrapper[587]: {"level":"info","cmd":"serve","method":"GET","request_uri":"/dijrshgr0dg50jkvhxs7kzxmvz9zci8p.narinfo","from":"[2001:db8:1::1]:36090","trace_id":"eadc1e028167a3647cd6177c6c22e68f","span_id":"3318ab9adea05b29","status":200,"elapsed":98.07848,"bytes":532,"time":"2026-10-07T05:21:08Z","message":"handled request"}2582bob # [ 20.981782] 70ya7n6byxa3fdhyxaknx3sks1f7mmwi-ncps-wrapper[587]: {"level":"info","cmd":"serve","method":"GET","request_uri":"/nar/1xmr8jicvzszfzpz46g37mlpvbzjl2wpwvl2b05psipssyp1sm8h.nar?hash=dijrshgr0dg50jkvhxs7kzxmvz9zci8p","from":"[2001:db8:1::1]:36090","trace_id":"637deb986db71f4e829d8aeaee5dad6e","span_id":"8e39b75f3a83b29e","status":200,"elapsed":0.54216,"bytes":95,"time":"2026-10-07T05:21:08Z","message":"handled request"}2583alice: (finished: must succeed: nix-build --expr '2584 builtins.derivation {2585 name = "hi";2586 builder = "/bin/sh";2587 args = [ "-c" "echo hi > $out" ];2588 system = "aarch64-linux";2589 }2590' 2>&12591, in 4.85 seconds)2592(finished: run the VM test script, in 21.79 seconds)2593test script finished in 21.93s2594cleanup2595kill QemuMachine (pid 48)2596alice # qemu-system-aarch64: terminating on signal 15 from pid 39 (/nix/store/81ag9nxz1flw3xjkv1vvqg8y2ipx2ins-python3-3.14.7/bin/python3.14)2597alice # [2026-10-07T05:21:09Z INFO virtiofsd] Client disconnected, shutting down2598alice # [2026-10-07T05:21:09Z INFO virtiofsd] Client disconnected, shutting down2599alice # [2026-10-07T05:21:09Z INFO virtiofsd] Client disconnected, shutting down2600kill QemuMachine (pid 49)2601bob # qemu-system-aarch64: terminating on signal 15 from pid 39 (/nix/store/81ag9nxz1flw3xjkv1vvqg8y2ipx2ins-python3-3.14.7/bin/python3.14)2602bob # [2026-10-07T05:21:09Z INFO virtiofsd] Client disconnected, shutting down2603bob # [2026-10-07T05:21:09Z INFO virtiofsd] Client disconnected, shutting down2604bob # [2026-10-07T05:21:09Z INFO virtiofsd] Client disconnected, shutting down2605kill QemuMachine (pid 50)2606clare # qemu-system-aarch64: terminating on signal 15 from pid 39 (/nix/store/81ag9nxz1flw3xjkv1vvqg8y2ipx2ins-python3-3.14.7/bin/python3.14)2607clare # [2026-10-07T05:21:09Z INFO virtiofsd] Client disconnected, shutting down2608clare # [2026-10-07T05:21:09Z INFO virtiofsd] Client disconnected, shutting down2609clare # [2026-10-07T05:21:09Z INFO virtiofsd] Client disconnected, shutting down2610(finished: cleanup, in 0.43 seconds)