these 17 derivations will be built: /nix/store/cmx2b0xb0fzavlgp8fq7z08dfhaswjgw-system-path.drv /nix/store/5vw05nafvzvm7x75mkhxpgnb7xzs0n1k-dbus-1.drv /nix/store/afsvzpw0hvk9wj4gl23wnsjn6j8l9adh-X-Restart-Triggers-dbus-broker.drv /nix/store/np7md0a045h9n056izy7scn282vp9d1n-unit-dbus-broker.service.drv /nix/store/0azjmyni7dkcnfsla9y1lipy28fa47xb-system-units.drv /nix/store/h5srzggl43md5dqypirwcdisxqlfk94s-unit-dbus-broker.service.drv /nix/store/zjq1s202407331dkks0p9n49628inxzk-user-units.drv /nix/store/hhmhq200h6zrvr4g8i2f7737hqnm4hvr-etc.drv /nix/store/089qqh2agpln9yp5b7nirzpmb34j2p9n-activate.drv /nix/store/5l1wgkq5shj851yz95ciy8n5qpmc7mvb-linux-6.18.49-modules.drv /nix/store/psgbgc81vk920xyw3jvalv0wvmb6ixcy-nixos-system-machine-test.drv /nix/store/igh1kdlfb51sfampwl5h4bh09q9x1wz3-closure-info.drv /nix/store/dcjc27jyawqz9zicyf0zrmpip9aph00d-run-nixos-vm.drv /nix/store/dc8mnk29zzf8l5wzb5wqdry73n04xsi9-nixos-vm.drv /nix/store/98yyppkbfiyz31pnfv2w5z0y4bs3h7li-driverConfiguration.json.drv /nix/store/rj1jpvw161nprqnyhwqhafqsl237a4b2-nixos-test-driver-secrets.drv /nix/store/5liklbi79swxydgqy9d03j3vcfhszz0i-vm-test-run-secrets.drv building '/nix/store/0azjmyni7dkcnfsla9y1lipy28fa47xb-system-units.drv' on 'ssh-ng://builder@build01.clan.lol' building '/nix/store/0azjmyni7dkcnfsla9y1lipy28fa47xb-system-units.drv' building '/nix/store/hhmhq200h6zrvr4g8i2f7737hqnm4hvr-etc.drv' on 'ssh-ng://builder@build01.clan.lol' building '/nix/store/hhmhq200h6zrvr4g8i2f7737hqnm4hvr-etc.drv' warning: SQLite database '/nix/var/nix/db/db.sqlite' is busy building '/nix/store/089qqh2agpln9yp5b7nirzpmb34j2p9n-activate.drv' on 'ssh-ng://builder@build01.clan.lol' building '/nix/store/089qqh2agpln9yp5b7nirzpmb34j2p9n-activate.drv' building '/nix/store/psgbgc81vk920xyw3jvalv0wvmb6ixcy-nixos-system-machine-test.drv' on 'ssh-ng://builder@build01.clan.lol' building '/nix/store/psgbgc81vk920xyw3jvalv0wvmb6ixcy-nixos-system-machine-test.drv' nixos-system-machine-test> structuredAttrs is enabled building '/nix/store/igh1kdlfb51sfampwl5h4bh09q9x1wz3-closure-info.drv' on 'ssh-ng://builder@build01.clan.lol' warning: SQLite database '/nix/var/nix/db/db.sqlite' is busy building '/nix/store/igh1kdlfb51sfampwl5h4bh09q9x1wz3-closure-info.drv' closure-info> structuredAttrs is enabled building '/nix/store/dcjc27jyawqz9zicyf0zrmpip9aph00d-run-nixos-vm.drv' on 'ssh-ng://builder@build01.clan.lol' building '/nix/store/dcjc27jyawqz9zicyf0zrmpip9aph00d-run-nixos-vm.drv' building '/nix/store/dc8mnk29zzf8l5wzb5wqdry73n04xsi9-nixos-vm.drv' on 'ssh-ng://builder@build01.clan.lol' building '/nix/store/dc8mnk29zzf8l5wzb5wqdry73n04xsi9-nixos-vm.drv' building '/nix/store/98yyppkbfiyz31pnfv2w5z0y4bs3h7li-driverConfiguration.json.drv' on 'ssh-ng://builder@build01.clan.lol' building '/nix/store/98yyppkbfiyz31pnfv2w5z0y4bs3h7li-driverConfiguration.json.drv' driverConfiguration.json> structuredAttrs is enabled warning: SQLite database '/nix/var/nix/db/db.sqlite' is busy building '/nix/store/rj1jpvw161nprqnyhwqhafqsl237a4b2-nixos-test-driver-secrets.drv' on 'ssh-ng://builder@build01.clan.lol' warning: SQLite database '/nix/var/nix/db/db.sqlite' is busy building '/nix/store/rj1jpvw161nprqnyhwqhafqsl237a4b2-nixos-test-driver-secrets.drv' nixos-test-driver-secrets> Running type check (enable/disable: config.skipTypeCheck) nixos-test-driver-secrets> See https://nixos.org/manual/nixos/stable/#test-opt-skipTypeCheck nixos-test-driver-secrets> All checks passed! nixos-test-driver-secrets> Linting test script (enable/disable: config.skipLint) nixos-test-driver-secrets> See https://nixos.org/manual/nixos/stable/#test-opt-skipLint nixos-test-driver-secrets> All checks passed! building '/nix/store/5liklbi79swxydgqy9d03j3vcfhszz0i-vm-test-run-secrets.drv' on 'ssh-ng://builder@build01.clan.lol' building '/nix/store/5liklbi79swxydgqy9d03j3vcfhszz0i-vm-test-run-secrets.drv' vm-test-run-secrets> Machine state will be reset. To keep it, pass --keep-machine-state vm-test-run-secrets> start all VLans vm-test-run-secrets> (finished: start all VLans, in 0.00 seconds) vm-test-run-secrets> Test will time out and terminate in 3600 seconds vm-test-run-secrets> run the VM test script vm-test-run-secrets> additionally exposed symbols: vm-test-run-secrets> machine, vm-test-run-secrets> vlan1, vm-test-run-secrets> 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_ssh vm-test-run-secrets> machine: must succeed: cat /etc/secret >&2 vm-test-run-secrets> machine: waiting for the VM to finish booting vm-test-run-secrets> machine: starting vm vm-test-run-secrets> machine # Disk image does not exist, creating the virtualisation disk image... vm-test-run-secrets> machine # Formatting '/build/vm-state-machine/tmp.QZiz98Df6z', fmt=raw size=1073741824 vm-test-run-secrets> machine # mke2fs 1.47.4 (6-Mar-2025) vm-test-run-secrets> machine # Discarding device blocks: 0/262144 done vm-test-run-secrets> machine # Creating filesystem with 262144 4k blocks and 65536 inodes vm-test-run-secrets> machine # Filesystem UUID: 1dd9c7ad-3402-4b55-9721-0d7eaa07e7da vm-test-run-secrets> machine # Superblock backups stored on blocks: vm-test-run-secrets> machine # 32768, 98304, 163840, 229376 vm-test-run-secrets> machine # vm-test-run-secrets> machine # Allocating group tables: 0/8 done vm-test-run-secrets> machine # Writing inode tables: 0/8 done vm-test-run-secrets> machine # Creating journal (8192 blocks): done vm-test-run-secrets> machine # Writing superblocks and filesystem accounting information: 0/8 done vm-test-run-secrets> machine # vm-test-run-secrets> machine # Virtualisation disk image created. vm-test-run-secrets> machine: QEMU running (pid 12) vm-test-run-secrets> machine # [ 0.000000] Booting Linux on physical CPU 0x0000000000 [0x413fd0c1] vm-test-run-secrets> machine # [ 0.000000] Linux version 6.18.49 (nixbld@localhost) (gcc (GCC) 15.2.0, GNU ld (GNU Binutils) 2.46) #1-NixOS SMP PREEMPT Wed Sep 2 12:31:51 UTC 2026 vm-test-run-secrets> machine # [ 0.000000] KASLR enabled vm-test-run-secrets> machine # [ 0.000000] random: crng init done vm-test-run-secrets> machine # [ 0.000000] Machine model: linux,dummy-virt vm-test-run-secrets> machine # [ 0.000000] efi: UEFI not found. vm-test-run-secrets> machine # [ 0.000000] OF: reserved mem: Reserved memory: No reserved-memory node in the DT vm-test-run-secrets> machine # [ 0.000000] NUMA: Faking a node at [mem 0x0000000040000000-0x000000007fffffff] vm-test-run-secrets> machine # [ 0.000000] NODE_DATA(0) allocated [mem 0x7fc07740-0x7fc0aebf] vm-test-run-secrets> machine # [ 0.000000] Zone ranges: vm-test-run-secrets> machine # [ 0.000000] DMA [mem 0x0000000040000000-0x000000007fffffff] vm-test-run-secrets> machine # [ 0.000000] DMA32 empty vm-test-run-secrets> machine # [ 0.000000] Normal empty vm-test-run-secrets> machine # [ 0.000000] Device empty vm-test-run-secrets> machine # [ 0.000000] Movable zone start for each node vm-test-run-secrets> machine # [ 0.000000] Early memory node ranges vm-test-run-secrets> machine # [ 0.000000] node 0: [mem 0x0000000040000000-0x000000007fffffff] vm-test-run-secrets> machine # [ 0.000000] Initmem setup node 0 [mem 0x0000000040000000-0x000000007fffffff] vm-test-run-secrets> machine # [ 0.000000] cma: Reserved 32 MiB at 0x000000007ca00000 vm-test-run-secrets> machine # [ 0.000000] psci: probing for conduit method from DT. vm-test-run-secrets> machine # [ 0.000000] psci: PSCIv1.3 detected in firmware. vm-test-run-secrets> machine # [ 0.000000] psci: Using standard PSCI v0.2 function IDs vm-test-run-secrets> machine # [ 0.000000] psci: Trusted OS migration not required vm-test-run-secrets> machine # [ 0.000000] psci: SMC Calling Convention v1.1 vm-test-run-secrets> machine # [ 0.000000] smccc: KVM: hypervisor services detected (0x00000000 0x00000000 0x00000000 0x00000003) vm-test-run-secrets> machine # [ 0.000000] percpu: Embedded 76 pages/cpu s186328 r8192 d116776 u311296 vm-test-run-secrets> machine # [ 0.000000] Detected PIPT I-cache on CPU0 vm-test-run-secrets> machine # [ 0.000000] CPU features: detected: GICv3 CPU interface vm-test-run-secrets> machine # [ 0.000000] CPU features: detected: Spectre-v4 vm-test-run-secrets> machine # [ 0.000000] CPU features: detected: Spectre-BHB vm-test-run-secrets> machine # [ 0.000000] CPU features: kernel page table isolation forced ON by KASLR vm-test-run-secrets> machine # [ 0.000000] CPU features: detected: Kernel page table isolation (KPTI) vm-test-run-secrets> machine # [ 0.000000] CPU features: detected: ARM erratum 1418040 vm-test-run-secrets> machine # [ 0.000000] CPU features: detected: Broken broadcast TLBI completion vm-test-run-secrets> machine # [ 0.000000] CPU features: detected: SSBS not fully self-synchronizing vm-test-run-secrets> machine # [ 0.000000] alternatives: applying boot alternatives vm-test-run-secrets> machine # [ 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/pnyfmszz583g38jjwfizdmqkr2qdg0cl-nixos-system-machine-test/init regInfo=/nix/store/z847v45ivn5bl2hq3f04dd2fm5c67b68-closure-info/registration console=ttyAMA0,115200n8 console=tty0 vm-test-run-secrets> machine # [ 0.000000] Unknown kernel command line parameters "regInfo=/nix/store/z847v45ivn5bl2hq3f04dd2fm5c67b68-closure-info/registration", will be passed to user space. vm-test-run-secrets> machine # [ 0.000000] printk: log buffer data + meta data: 131072 + 458752 = 589824 bytes vm-test-run-secrets> machine # [ 0.000000] Dentry cache hash table entries: 131072 (order: 8, 1048576 bytes, linear) vm-test-run-secrets> machine # [ 0.000000] Inode-cache hash table entries: 65536 (order: 7, 524288 bytes, linear) vm-test-run-secrets> machine # [ 0.000000] software IO TLB: SWIOTLB bounce buffer size adjusted to 1MB vm-test-run-secrets> machine # [ 0.000000] software IO TLB: area num 1. vm-test-run-secrets> machine # [ 0.000000] software IO TLB: mapped [mem 0x000000007c900000-0x000000007ca00000] (1MB) vm-test-run-secrets> machine # [ 0.000000] Fallback order for Node 0: 0 vm-test-run-secrets> machine # [ 0.000000] Built 1 zonelists, mobility grouping on. Total pages: 262144 vm-test-run-secrets> machine # [ 0.000000] Policy zone: DMA vm-test-run-secrets> machine # [ 0.000000] mem auto-init: stack:all(zero), heap alloc:on, heap free:off vm-test-run-secrets> machine # [ 0.000000] SLUB: HWalign=64, Order=0-3, MinObjects=0, CPUs=1, Nodes=1 vm-test-run-secrets> machine # [ 0.000000] allocated 2097152 bytes of page_ext vm-test-run-secrets> machine # [ 0.000000] ftrace: allocating 74760 entries in 294 pages vm-test-run-secrets> machine # [ 0.000000] ftrace: allocated 294 pages with 4 groups vm-test-run-secrets> machine # [ 0.000000] rcu: Hierarchical RCU implementation. vm-test-run-secrets> machine # [ 0.000000] rcu: RCU event tracing is enabled. vm-test-run-secrets> machine # [ 0.000000] rcu: RCU restricting CPUs from NR_CPUS=384 to nr_cpu_ids=1. vm-test-run-secrets> machine # [ 0.000000] Trampoline variant of Tasks RCU enabled. vm-test-run-secrets> machine # [ 0.000000] Rude variant of Tasks RCU enabled. vm-test-run-secrets> machine # [ 0.000000] Tracing variant of Tasks RCU enabled. vm-test-run-secrets> machine # [ 0.000000] rcu: RCU calculated value of scheduler-enlistment delay is 25 jiffies. vm-test-run-secrets> machine # [ 0.000000] rcu: Adjusting geometry for rcu_fanout_leaf=16, nr_cpu_ids=1 vm-test-run-secrets> machine # [ 0.000000] RCU Tasks: Setting shift to 0 and lim to 1 rcu_task_cb_adjust=1 rcu_task_cpu_ids=1. vm-test-run-secrets> machine # [ 0.000000] RCU Tasks Rude: Setting shift to 0 and lim to 1 rcu_task_cb_adjust=1 rcu_task_cpu_ids=1. vm-test-run-secrets> machine # [ 0.000000] RCU Tasks Trace: Setting shift to 0 and lim to 1 rcu_task_cb_adjust=1 rcu_task_cpu_ids=1. vm-test-run-secrets> machine # [ 0.000000] NR_IRQS: 64, nr_irqs: 64, preallocated irqs: 0 vm-test-run-secrets> machine # [ 0.000000] GICv3: 256 SPIs implemented vm-test-run-secrets> machine # [ 0.000000] GICv3: 0 Extended SPIs implemented vm-test-run-secrets> machine # [ 0.000000] Root IRQ handler: gic_handle_irq vm-test-run-secrets> machine # [ 0.000000] GICv3: GICv3 features: 16 PPIs, DirectLPI vm-test-run-secrets> machine # [ 0.000000] GICv3: GICD_CTLR.DS=1, SCR_EL3.FIQ=0 vm-test-run-secrets> machine # [ 0.000000] GICv3: CPU0: found redistributor 0 region 0:0x00000000080a0000 vm-test-run-secrets> machine # [ 0.000000] ITS [mem 0x08080000-0x0809ffff] vm-test-run-secrets> machine # [ 0.000000] ITS@0x0000000008080000: allocated 8192 Devices @44ce0000 (indirect, esz 8, psz 64K, shr 1) vm-test-run-secrets> machine # [ 0.000000] ITS@0x0000000008080000: allocated 8192 Interrupt Collections @44cf0000 (flat, esz 8, psz 64K, shr 1) vm-test-run-secrets> machine # [ 0.000000] GICv3: using LPI property table @0x0000000044d00000 vm-test-run-secrets> machine # [ 0.000000] GICv3: CPU0: using allocated LPI pending table @0x0000000044d10000 vm-test-run-secrets> machine # [ 0.000000] rcu: srcu_init: Setting srcu_struct sizes based on contention. vm-test-run-secrets> machine # [ 0.000000] clocksource: jiffies: mask: 0xffffffff max_cycles: 0xffffffff, max_idle_ns: 7645041785100000 ns vm-test-run-secrets> machine # [ 0.000000] arch_timer: Enabling local workaround for ARM erratum 1418040 vm-test-run-secrets> machine # [ 0.000000] arch_timer: cp15 timer running at 25.00MHz (virt). vm-test-run-secrets> machine # [ 0.000000] clocksource: arch_sys_counter: mask: 0xffffffffffffff max_cycles: 0x5c40939b5, max_idle_ns: 440795202646 ns vm-test-run-secrets> machine # [ 0.000000] sched_clock: 56 bits at 25MHz, resolution 40ns, wraps every 4398046511100ns vm-test-run-secrets> machine # [ 0.000051] arm-pv: using stolen time PV vm-test-run-secrets> machine # [ 0.000357] kfence: initialized - using 2097152 bytes for 255 objects at 0x(____ptrval____)-0x(____ptrval____) vm-test-run-secrets> machine # [ 0.000649] Console: colour dummy device 80x25 vm-test-run-secrets> machine # [ 0.000665] printk: legacy console [tty0] enabled vm-test-run-secrets> machine # [ 0.000870] Calibrating delay loop (skipped), value calculated using timer frequency.. 50.00 BogoMIPS (lpj=100000) vm-test-run-secrets> machine # [ 0.000875] pid_max: default: 32768 minimum: 301 vm-test-run-secrets> machine # [ 0.000951] LSM: initializing lsm=capability,landlock,yama,bpf,ima vm-test-run-secrets> machine # [ 0.001085] landlock: Up and running. vm-test-run-secrets> machine # [ 0.001087] Yama: becoming mindful. vm-test-run-secrets> machine # [ 0.001453] LSM support for eBPF active vm-test-run-secrets> machine # [ 0.001605] Mount-cache hash table entries: 2048 (order: 2, 16384 bytes, linear) vm-test-run-secrets> machine # [ 0.001629] Mountpoint-cache hash table entries: 2048 (order: 2, 16384 bytes, linear) vm-test-run-secrets> machine # [ 0.003363] cacheinfo: Unable to detect cache hierarchy for CPU 0 vm-test-run-secrets> machine # [ 0.004236] rcu: Hierarchical SRCU implementation. vm-test-run-secrets> machine # [ 0.004241] rcu: Max phase no-delay instances is 1000. vm-test-run-secrets> machine # [ 0.005181] fsl-mc MSI: its@8080000 domain created vm-test-run-secrets> machine # [ 0.005322] EFI services will not be available. vm-test-run-secrets> machine # [ 0.005410] smp: Bringing up secondary CPUs ... vm-test-run-secrets> machine # [ 0.005436] smp: Brought up 1 node, 1 CPU vm-test-run-secrets> machine # [ 0.005438] SMP: Total of 1 processors activated. vm-test-run-secrets> machine # [ 0.005440] CPU: All CPU(s) started at EL1 vm-test-run-secrets> machine # [ 0.005452] CPU features: detected: 32-bit EL0 Support vm-test-run-secrets> machine # [ 0.005454] CPU features: detected: Data cache clean to the PoU not required for I/D coherence vm-test-run-secrets> machine # [ 0.005457] CPU features: detected: Common not Private translations vm-test-run-secrets> machine # [ 0.005460] CPU features: detected: CRC32 instructions vm-test-run-secrets> machine # [ 0.005461] CPU features: detected: Data cache clean to Point of Persistence vm-test-run-secrets> machine # [ 0.005464] CPU features: detected: Enhanced Virtualization Traps vm-test-run-secrets> machine # [ 0.005472] CPU features: detected: RCpc load-acquire (LDAPR) vm-test-run-secrets> machine # [ 0.005474] CPU features: detected: LSE atomic instructions vm-test-run-secrets> machine # [ 0.005476] CPU features: detected: Privileged Access Never vm-test-run-secrets> machine # [ 0.005478] CPU features: detected: PMUv3 vm-test-run-secrets> machine # [ 0.005480] CPU features: detected: RAS Extension Support vm-test-run-secrets> machine # [ 0.005483] CPU features: detected: Speculative Store Bypassing Safe (SSBS) vm-test-run-secrets> machine # [ 0.005503] alternatives: applying system-wide alternatives vm-test-run-secrets> machine # [ 0.006901] CPU features: detected: Hardware dirty bit management on CPU0 vm-test-run-secrets> machine # [ 0.007084] Memory: 893868K/1048576K available (24320K kernel code, 7086K rwdata, 26340K rodata, 4736K init, 1103K bss, 113400K reserved, 32768K cma-reserved) vm-test-run-secrets> machine # [ 0.007599] devtmpfs: initialized vm-test-run-secrets> machine # [ 0.009149] posixtimers hash table entries: 512 (order: 1, 8192 bytes, linear) vm-test-run-secrets> machine # [ 0.009173] futex hash table entries: 256 (16384 bytes on 1 NUMA nodes, total 16 KiB, linear). vm-test-run-secrets> machine # [ 0.009301] 2G module region forced by RANDOMIZE_MODULE_REGION_FULL vm-test-run-secrets> machine # [ 0.009305] 0 pages in range for non-PLT usage vm-test-run-secrets> machine # [ 0.009305] 508336 pages in range for PLT usage vm-test-run-secrets> machine # [ 0.009434] pinctrl core: initialized pinctrl subsystem vm-test-run-secrets> machine # [ 0.010171] DMI not present or invalid. vm-test-run-secrets> machine # [ 0.013628] NET: Registered PF_NETLINK/PF_ROUTE protocol family vm-test-run-secrets> machine # [ 0.016402] DMA: preallocated 128 KiB GFP_KERNEL pool for atomic allocations vm-test-run-secrets> machine # [ 0.016558] DMA: preallocated 128 KiB GFP_KERNEL|GFP_DMA pool for atomic allocations vm-test-run-secrets> machine # [ 0.016735] DMA: preallocated 128 KiB GFP_KERNEL|GFP_DMA32 pool for atomic allocations vm-test-run-secrets> machine # [ 0.016758] audit: initializing netlink subsys (disabled) vm-test-run-secrets> machine # [ 0.017427] thermal_sys: Registered thermal governor 'fair_share' vm-test-run-secrets> machine # [ 0.017429] thermal_sys: Registered thermal governor 'bang_bang' vm-test-run-secrets> machine # [ 0.017432] thermal_sys: Registered thermal governor 'step_wise' vm-test-run-secrets> machine # [ 0.017435] thermal_sys: Registered thermal governor 'user_space' vm-test-run-secrets> machine # [ 0.017437] thermal_sys: Registered thermal governor 'power_allocator' vm-test-run-secrets> machine # [ 0.017484] audit: type=2000 audit(0.016:1): state=initialized audit_enabled=0 res=1 vm-test-run-secrets> machine # [ 0.017498] cpuidle: using governor ladder vm-test-run-secrets> machine # [ 0.017503] cpuidle: using governor menu vm-test-run-secrets> machine # [ 0.017631] hw-breakpoint: found 6 breakpoint and 4 watchpoint registers. vm-test-run-secrets> machine # [ 0.017653] ASID allocator initialised with 32768 entries vm-test-run-secrets> machine # [ 0.018348] Serial: AMBA PL011 UART driver vm-test-run-secrets> machine # [ 0.021441] 9000000.pl011: ttyAMA0 at MMIO 0x9000000 (irq = 13, base_baud = 0) is a PL011 rev1 vm-test-run-secrets> machine # [ 0.021586] printk: console [ttyAMA0] enabled vm-test-run-secrets> machine # [ 0.093752] HugeTLB: registered 1.00 GiB page size, pre-allocated 0 pages vm-test-run-secrets> machine # [ 0.093779] HugeTLB: 0 KiB vmemmap can be freed for a 1.00 GiB page vm-test-run-secrets> machine # [ 0.093786] HugeTLB: registered 32.0 MiB page size, pre-allocated 0 pages vm-test-run-secrets> machine # [ 0.093790] HugeTLB: 0 KiB vmemmap can be freed for a 32.0 MiB page vm-test-run-secrets> machine # [ 0.093793] HugeTLB: registered 2.00 MiB page size, pre-allocated 0 pages vm-test-run-secrets> machine # [ 0.093796] HugeTLB: 0 KiB vmemmap can be freed for a 2.00 MiB page vm-test-run-secrets> machine # [ 0.093800] HugeTLB: registered 64.0 KiB page size, pre-allocated 0 pages vm-test-run-secrets> machine # [ 0.093802] HugeTLB: 0 KiB vmemmap can be freed for a 64.0 KiB page vm-test-run-secrets> machine # [ 0.098836] fbcon: Taking over console vm-test-run-secrets> machine # [ 0.098860] ACPI: Interpreter disabled. vm-test-run-secrets> machine # [ 0.100085] iommu: Default domain type: Translated vm-test-run-secrets> machine # [ 0.100097] iommu: DMA domain TLB invalidation policy: strict mode vm-test-run-secrets> machine # [ 0.101222] SCSI subsystem initialized vm-test-run-secrets> machine # [ 0.109862] usbcore: registered new interface driver usbfs vm-test-run-secrets> machine # [ 0.109901] usbcore: registered new interface driver hub vm-test-run-secrets> machine # [ 0.109927] usbcore: registered new device driver usb vm-test-run-secrets> machine # [ 0.110137] pps_core: LinuxPPS API ver. 1 registered vm-test-run-secrets> machine # [ 0.110142] pps_core: Software ver. 5.3.6 - Copyright 2005-2007 Rodolfo Giometti vm-test-run-secrets> machine # [ 0.110149] PTP clock support registered vm-test-run-secrets> machine # [ 0.110198] EDAC MC: Ver: 3.0.0 vm-test-run-secrets> machine # [ 0.113187] scmi_core: SCMI protocol bus registered vm-test-run-secrets> machine # [ 0.114012] FPGA manager framework vm-test-run-secrets> machine # [ 0.115286] vgaarb: loaded vm-test-run-secrets> machine # [ 0.115772] clocksource: Switched to clocksource arch_sys_counter vm-test-run-secrets> machine # [ 0.121857] VFS: Disk quotas dquot_6.6.0 vm-test-run-secrets> machine # [ 0.121907] VFS: Dquot-cache hash table entries: 512 (order 0, 4096 bytes) vm-test-run-secrets> machine # [ 0.124525] netfs: FS-Cache loaded vm-test-run-secrets> machine # [ 0.124823] pnp: PnP ACPI: disabled vm-test-run-secrets> machine # [ 0.127343] NET: Registered PF_INET protocol family vm-test-run-secrets> machine # [ 0.127542] IP idents hash table entries: 16384 (order: 5, 131072 bytes, linear) vm-test-run-secrets> machine # [ 0.152334] tcp_listen_portaddr_hash hash table entries: 512 (order: 1, 8192 bytes, linear) vm-test-run-secrets> machine # [ 0.152369] Table-perturb hash table entries: 65536 (order: 6, 262144 bytes, linear) vm-test-run-secrets> machine # [ 0.152384] TCP established hash table entries: 8192 (order: 4, 65536 bytes, linear) vm-test-run-secrets> machine # [ 0.152425] TCP bind hash table entries: 8192 (order: 6, 262144 bytes, linear) vm-test-run-secrets> machine # [ 0.152493] TCP: Hash tables configured (established 8192 bind 8192) vm-test-run-secrets> machine # [ 0.152616] MPTCP token hash table entries: 1024 (order: 3, 24576 bytes, linear) vm-test-run-secrets> machine # [ 0.152649] UDP hash table entries: 512 (order: 3, 32768 bytes, linear) vm-test-run-secrets> machine # [ 0.152673] UDP-Lite hash table entries: 512 (order: 3, 32768 bytes, linear) vm-test-run-secrets> machine # [ 0.152792] NET: Registered PF_UNIX/PF_LOCAL protocol family vm-test-run-secrets> machine # [ 0.152824] NET: Registered PF_XDP protocol family vm-test-run-secrets> machine # [ 0.152846] PCI: CLS 0 bytes, default 64 vm-test-run-secrets> machine # [ 0.153075] Trying to unpack rootfs image as initramfs... vm-test-run-secrets> machine # [ 0.166224] kvm [1]: HYP mode not available vm-test-run-secrets> machine # [ 0.240207] Initialise system trusted keyrings vm-test-run-secrets> machine # [ 0.240766] workingset: timestamp_bits=42 max_order=18 bucket_order=0 vm-test-run-secrets> machine # [ 0.241788] squashfs: version 4.0 (2009/01/31) Phillip Lougher vm-test-run-secrets> machine # [ 0.242344] 9p: Installing v9fs 9p2000 file system support vm-test-run-secrets> machine # [ 0.261732] Key type asymmetric registered vm-test-run-secrets> machine # [ 0.261763] Asymmetric key parser 'x509' registered vm-test-run-secrets> machine # [ 0.261840] Block layer SCSI generic (bsg) driver version 0.4 loaded (major 242) vm-test-run-secrets> machine # [ 0.267880] io scheduler mq-deadline registered vm-test-run-secrets> machine # [ 0.267904] io scheduler kyber registered vm-test-run-secrets> machine # [ 0.270911] pl061_gpio 9030000.pl061: PL061 GPIO chip registered vm-test-run-secrets> machine # [ 0.271744] ledtrig-cpu: registered to indicate activity on CPUs vm-test-run-secrets> machine # [ 0.272600] pci-host-generic 4010000000.pcie: host bridge /pcie@10000000 ranges: vm-test-run-secrets> machine # [ 0.272630] pci-host-generic 4010000000.pcie: IO 0x003eff0000..0x003effffff -> 0x0000000000 vm-test-run-secrets> machine # [ 0.272645] pci-host-generic 4010000000.pcie: MEM 0x0010000000..0x003efeffff -> 0x0010000000 vm-test-run-secrets> machine # [ 0.272651] pci-host-generic 4010000000.pcie: MEM 0x8000000000..0xffffffffff -> 0x8000000000 vm-test-run-secrets> machine # [ 0.272684] pci-host-generic 4010000000.pcie: Memory resource size exceeds max for 32 bits vm-test-run-secrets> machine # [ 0.272713] pci-host-generic 4010000000.pcie: ECAM at [mem 0x4010000000-0x401fffffff] for [bus 00-ff] vm-test-run-secrets> machine # [ 0.272809] pci-host-generic 4010000000.pcie: PCI host bridge to bus 0000:00 vm-test-run-secrets> machine # [ 0.272829] pci_bus 0000:00: root bus resource [bus 00-ff] vm-test-run-secrets> machine # [ 0.272835] pci_bus 0000:00: root bus resource [io 0x0000-0xffff] vm-test-run-secrets> machine # [ 0.272838] pci_bus 0000:00: root bus resource [mem 0x10000000-0x3efeffff] vm-test-run-secrets> machine # [ 0.272842] pci_bus 0000:00: root bus resource [mem 0x8000000000-0xffffffffff] vm-test-run-secrets> machine # [ 0.272930] pci 0000:00:00.0: [1b36:0008] type 00 class 0x060000 conventional PCI endpoint vm-test-run-secrets> machine # [ 0.273374] pci 0000:00:01.0: [1af4:1000] type 00 class 0x020000 conventional PCI endpoint vm-test-run-secrets> machine # [ 0.273494] pci 0000:00:01.0: BAR 0 [io 0x0000-0x001f] vm-test-run-secrets> machine # [ 0.273505] pci 0000:00:01.0: BAR 1 [mem 0x00000000-0x00000fff] vm-test-run-secrets> machine # [ 0.273527] pci 0000:00:01.0: BAR 4 [mem 0x00000000-0x00003fff 64bit pref] vm-test-run-secrets> machine # [ 0.273538] pci 0000:00:01.0: ROM [mem 0x00000000-0x0003ffff pref] vm-test-run-secrets> machine # [ 0.273828] pci 0000:00:02.0: [1af4:1005] type 00 class 0x00ff00 conventional PCI endpoint vm-test-run-secrets> machine # [ 0.273946] pci 0000:00:02.0: BAR 0 [io 0x0000-0x001f] vm-test-run-secrets> machine # [ 0.273957] pci 0000:00:02.0: BAR 1 [mem 0x00000000-0x00000fff] vm-test-run-secrets> machine # [ 0.273978] pci 0000:00:02.0: BAR 4 [mem 0x00000000-0x00003fff 64bit pref] vm-test-run-secrets> machine # [ 0.274280] pci 0000:00:03.0: [1af4:1009] type 00 class 0x000200 conventional PCI endpoint vm-test-run-secrets> machine # [ 0.274396] pci 0000:00:03.0: BAR 0 [io 0x0000-0x003f] vm-test-run-secrets> machine # [ 0.274406] pci 0000:00:03.0: BAR 1 [mem 0x00000000-0x00000fff] vm-test-run-secrets> machine # [ 0.274427] pci 0000:00:03.0: BAR 4 [mem 0x00000000-0x00003fff 64bit pref] vm-test-run-secrets> machine # [ 0.274709] pci 0000:00:04.0: [1af4:1009] type 00 class 0x000200 conventional PCI endpoint vm-test-run-secrets> machine # [ 0.274823] pci 0000:00:04.0: BAR 0 [io 0x0000-0x001f] vm-test-run-secrets> machine # [ 0.274833] pci 0000:00:04.0: BAR 1 [mem 0x00000000-0x00000fff] vm-test-run-secrets> machine # [ 0.274852] pci 0000:00:04.0: BAR 4 [mem 0x00000000-0x00003fff 64bit pref] vm-test-run-secrets> machine # [ 0.275143] pci 0000:00:05.0: [1af4:1009] type 00 class 0x000200 conventional PCI endpoint vm-test-run-secrets> machine # [ 0.275257] pci 0000:00:05.0: BAR 0 [io 0x0000-0x001f] vm-test-run-secrets> machine # [ 0.275267] pci 0000:00:05.0: BAR 1 [mem 0x00000000-0x00000fff] vm-test-run-secrets> machine # [ 0.275288] pci 0000:00:05.0: BAR 4 [mem 0x00000000-0x00003fff 64bit pref] vm-test-run-secrets> machine # [ 0.275574] pci 0000:00:06.0: [1af4:1001] type 00 class 0x010000 conventional PCI endpoint vm-test-run-secrets> machine # [ 0.275689] pci 0000:00:06.0: BAR 0 [io 0x0000-0x007f] vm-test-run-secrets> machine # [ 0.275699] pci 0000:00:06.0: BAR 1 [mem 0x00000000-0x00000fff] vm-test-run-secrets> machine # [ 0.275719] pci 0000:00:06.0: BAR 4 [mem 0x00000000-0x00003fff 64bit pref] vm-test-run-secrets> machine # [ 0.300160] pci 0000:00:07.0: [1af4:1000] type 00 class 0x020000 conventional PCI endpoint vm-test-run-secrets> machine # [ 0.300297] pci 0000:00:07.0: BAR 0 [io 0x0000-0x001f] vm-test-run-secrets> machine # [ 0.300308] pci 0000:00:07.0: BAR 1 [mem 0x00000000-0x00000fff] vm-test-run-secrets> machine # [ 0.300333] pci 0000:00:07.0: BAR 4 [mem 0x00000000-0x00003fff 64bit pref] vm-test-run-secrets> machine # [ 0.300345] pci 0000:00:07.0: ROM [mem 0x00000000-0x0003ffff pref] vm-test-run-secrets> machine # [ 0.300650] pci 0000:00:08.0: [1af4:1052] type 00 class 0x090000 conventional PCI endpoint vm-test-run-secrets> machine # [ 0.300767] pci 0000:00:08.0: BAR 1 [mem 0x00000000-0x00000fff] vm-test-run-secrets> machine # [ 0.300787] pci 0000:00:08.0: BAR 4 [mem 0x00000000-0x00003fff 64bit pref] vm-test-run-secrets> machine # [ 0.301067] pci 0000:00:09.0: [1af4:1050] type 00 class 0x038000 conventional PCI endpoint vm-test-run-secrets> machine # [ 0.301182] pci 0000:00:09.0: BAR 1 [mem 0x00000000-0x00000fff] vm-test-run-secrets> machine # [ 0.301202] pci 0000:00:09.0: BAR 4 [mem 0x00000000-0x00003fff 64bit pref] vm-test-run-secrets> machine # [ 0.301454] pci 0000:00:0a.0: [8086:24cd] type 00 class 0x0c0320 conventional PCI endpoint vm-test-run-secrets> machine # [ 0.301565] pci 0000:00:0a.0: BAR 0 [mem 0x00000000-0x00000fff] vm-test-run-secrets> machine # [ 0.301741] pci 0000:00:0b.0: [1af4:1003] type 00 class 0x078000 conventional PCI endpoint vm-test-run-secrets> machine # [ 0.301902] pci 0000:00:0b.0: BAR 0 [io 0x0000-0x003f] vm-test-run-secrets> machine # [ 0.301913] pci 0000:00:0b.0: BAR 1 [mem 0x00000000-0x00000fff] vm-test-run-secrets> machine # [ 0.301984] pci 0000:00:0b.0: BAR 4 [mem 0x00000000-0x00003fff 64bit pref] vm-test-run-secrets> machine # [ 0.302288] pci 0000:00:0c.0: [1af4:1005] type 00 class 0x00ff00 conventional PCI endpoint vm-test-run-secrets> machine # [ 0.302403] pci 0000:00:0c.0: BAR 0 [io 0x0000-0x001f] vm-test-run-secrets> machine # [ 0.302414] pci 0000:00:0c.0: BAR 1 [mem 0x00000000-0x00000fff] vm-test-run-secrets> machine # [ 0.302435] pci 0000:00:0c.0: BAR 4 [mem 0x00000000-0x00003fff 64bit pref] vm-test-run-secrets> machine # [ 0.302838] pci 0000:00:01.0: ROM [mem 0x10000000-0x1003ffff pref]: assigned vm-test-run-secrets> machine # [ 0.302848] pci 0000:00:07.0: ROM [mem 0x10040000-0x1007ffff pref]: assigned vm-test-run-secrets> machine # [ 0.302853] pci 0000:00:01.0: BAR 4 [mem 0x8000000000-0x8000003fff 64bit pref]: assigned vm-test-run-secrets> machine # [ 0.302888] pci 0000:00:02.0: BAR 4 [mem 0x8000004000-0x8000007fff 64bit pref]: assigned vm-test-run-secrets> machine # [ 0.302918] pci 0000:00:03.0: BAR 4 [mem 0x8000008000-0x800000bfff 64bit pref]: assigned vm-test-run-secrets> machine # [ 0.302950] pci 0000:00:04.0: BAR 4 [mem 0x800000c000-0x800000ffff 64bit pref]: assigned vm-test-run-secrets> machine # [ 0.302982] pci 0000:00:05.0: BAR 4 [mem 0x8000010000-0x8000013fff 64bit pref]: assigned vm-test-run-secrets> machine # [ 0.303014] pci 0000:00:06.0: BAR 4 [mem 0x8000014000-0x8000017fff 64bit pref]: assigned vm-test-run-secrets> machine # [ 0.303046] pci 0000:00:07.0: BAR 4 [mem 0x8000018000-0x800001bfff 64bit pref]: assigned vm-test-run-secrets> machine # [ 0.303078] pci 0000:00:08.0: BAR 4 [mem 0x800001c000-0x800001ffff 64bit pref]: assigned vm-test-run-secrets> machine # [ 0.303109] pci 0000:00:09.0: BAR 4 [mem 0x8000020000-0x8000023fff 64bit pref]: assigned vm-test-run-secrets> machine # [ 0.303139] pci 0000:00:0b.0: BAR 4 [mem 0x8000024000-0x8000027fff 64bit pref]: assigned vm-test-run-secrets> machine # [ 0.303219] pci 0000:00:0c.0: BAR 4 [mem 0x8000028000-0x800002bfff 64bit pref]: assigned vm-test-run-secrets> machine # [ 0.303249] pci 0000:00:01.0: BAR 1 [mem 0x10080000-0x10080fff]: assigned vm-test-run-secrets> machine # [ 0.303264] pci 0000:00:02.0: BAR 1 [mem 0x10081000-0x10081fff]: assigned vm-test-run-secrets> machine # [ 0.303278] pci 0000:00:03.0: BAR 1 [mem 0x10082000-0x10082fff]: assigned vm-test-run-secrets> machine # [ 0.303294] pci 0000:00:04.0: BAR 1 [mem 0x10083000-0x10083fff]: assigned vm-test-run-secrets> machine # [ 0.303310] pci 0000:00:05.0: BAR 1 [mem 0x10084000-0x10084fff]: assigned vm-test-run-secrets> machine # [ 0.303326] pci 0000:00:06.0: BAR 1 [mem 0x10085000-0x10085fff]: assigned vm-test-run-secrets> machine # [ 0.303342] pci 0000:00:07.0: BAR 1 [mem 0x10086000-0x10086fff]: assigned vm-test-run-secrets> machine # [ 0.303358] pci 0000:00:08.0: BAR 1 [mem 0x10087000-0x10087fff]: assigned vm-test-run-secrets> machine # [ 0.303373] pci 0000:00:09.0: BAR 1 [mem 0x10088000-0x10088fff]: assigned vm-test-run-secrets> machine # [ 0.303389] pci 0000:00:0a.0: BAR 0 [mem 0x10089000-0x10089fff]: assigned vm-test-run-secrets> machine # [ 0.303406] pci 0000:00:0b.0: BAR 1 [mem 0x1008a000-0x1008afff]: assigned vm-test-run-secrets> machine # [ 0.303421] pci 0000:00:0c.0: BAR 1 [mem 0x1008b000-0x1008bfff]: assigned vm-test-run-secrets> machine # [ 0.303436] pci 0000:00:06.0: BAR 0 [io 0x1000-0x107f]: assigned vm-test-run-secrets> machine # [ 0.303451] pci 0000:00:03.0: BAR 0 [io 0x1080-0x10bf]: assigned vm-test-run-secrets> machine # [ 0.303466] pci 0000:00:0b.0: BAR 0 [io 0x10c0-0x10ff]: assigned vm-test-run-secrets> machine # [ 0.303482] pci 0000:00:01.0: BAR 0 [io 0x1100-0x111f]: assigned vm-test-run-secrets> machine # [ 0.303504] pci 0000:00:02.0: BAR 0 [io 0x1120-0x113f]: assigned vm-test-run-secrets> machine # [ 0.303520] pci 0000:00:04.0: BAR 0 [io 0x1140-0x115f]: assigned vm-test-run-secrets> machine # [ 0.303535] pci 0000:00:05.0: BAR 0 [io 0x1160-0x117f]: assigned vm-test-run-secrets> machine # [ 0.303550] pci 0000:00:07.0: BAR 0 [io 0x1180-0x119f]: assigned vm-test-run-secrets> machine # [ 0.303566] pci 0000:00:0c.0: BAR 0 [io 0x11a0-0x11bf]: assigned vm-test-run-secrets> machine # [ 0.303587] pci_bus 0000:00: resource 4 [io 0x0000-0xffff] vm-test-run-secrets> machine # [ 0.303593] pci_bus 0000:00: resource 5 [mem 0x10000000-0x3efeffff] vm-test-run-secrets> machine # [ 0.303598] pci_bus 0000:00: resource 6 [mem 0x8000000000-0xffffffffff] vm-test-run-secrets> machine # [ 0.340425] pci 0000:00:0a.0: enabling device (0000 -> 0002) vm-test-run-secrets> machine # [ 0.353023] virtio-pci 0000:00:01.0: enabling device (0000 -> 0003) vm-test-run-secrets> machine # [ 0.355190] virtio-pci 0000:00:02.0: enabling device (0000 -> 0003) vm-test-run-secrets> machine # [ 0.366362] virtio-pci 0000:00:03.0: enabling device (0000 -> 0003) vm-test-run-secrets> machine # [ 0.376363] virtio-pci 0000:00:04.0: enabling device (0000 -> 0003) vm-test-run-secrets> machine # [ 0.379890] virtio-pci 0000:00:05.0: enabling device (0000 -> 0003) vm-test-run-secrets> machine # [ 0.381849] virtio-pci 0000:00:06.0: enabling device (0000 -> 0003) vm-test-run-secrets> machine # [ 0.391984] virtio-pci 0000:00:07.0: enabling device (0000 -> 0003) vm-test-run-secrets> machine # [ 0.395123] virtio-pci 0000:00:08.0: enabling device (0000 -> 0002) vm-test-run-secrets> machine # [ 0.397916] virtio-pci 0000:00:09.0: enabling device (0000 -> 0002) vm-test-run-secrets> machine # [ 0.407973] virtio-pci 0000:00:0b.0: enabling device (0000 -> 0003) vm-test-run-secrets> machine # [ 0.410911] virtio-pci 0000:00:0c.0: enabling device (0000 -> 0003) vm-test-run-secrets> machine # [ 0.423674] Serial: 8250/16550 driver, 4 ports, IRQ sharing enabled vm-test-run-secrets> machine # [ 0.425339] msm_serial: driver initialized vm-test-run-secrets> machine # [ 0.425436] SuperH (H)SCI(F) driver initialized vm-test-run-secrets> machine # [ 0.425471] STM32 USART driver initialized vm-test-run-secrets> machine # [ 0.450105] loop: module loaded vm-test-run-secrets> machine # [ 0.450318] virtio_blk virtio5: 1/0/0 default/read/poll queues vm-test-run-secrets> machine # [ 0.450930] virtio_blk virtio5: [vda] 2097152 512-byte logical blocks (1.07 GB/1.00 GiB) vm-test-run-secrets> machine # [ 0.456376] megasas: 07.734.00.00-rc1 vm-test-run-secrets> machine # [ 0.456929] physmap-flash 0.flash: physmap platform flash device: [mem 0x00000000-0x03ffffff] vm-test-run-secrets> machine # [ 0.467816] 0.flash: Found 2 x16 devices at 0x0 in 32-bit bank. Manufacturer ID 0x000000 Chip ID 0x000000 vm-test-run-secrets> machine # [ 0.467860] Intel/Sharp Extended Query Table at 0x0031 vm-test-run-secrets> machine # [ 0.470033] Using buffer write method vm-test-run-secrets> machine # [ 0.470118] physmap-flash 0.flash: physmap platform flash device: [mem 0x04000000-0x07ffffff] vm-test-run-secrets> machine # [ 0.471919] 0.flash: Found 2 x16 devices at 0x0 in 32-bit bank. Manufacturer ID 0x000000 Chip ID 0x000000 vm-test-run-secrets> machine # [ 0.471938] Intel/Sharp Extended Query Table at 0x0031 vm-test-run-secrets> machine # [ 0.473822] Using buffer write method vm-test-run-secrets> machine # [ 0.473851] Concatenating MTD devices: vm-test-run-secrets> machine # [ 0.473856] (0): "0.flash" vm-test-run-secrets> machine # [ 0.473859] (1): "0.flash" vm-test-run-secrets> machine # [ 0.473861] into device "0.flash" vm-test-run-secrets> machine # [ 0.695357] Freeing initrd memory: 24792K vm-test-run-secrets> machine # [ 0.702517] tun: Universal TUN/TAP device driver, 1.6 vm-test-run-secrets> machine # [ 0.705406] thunder_xcv, ver 1.0 vm-test-run-secrets> machine # [ 0.705449] thunder_bgx, ver 1.0 vm-test-run-secrets> machine # [ 0.705460] nicpf, ver 1.0 vm-test-run-secrets> machine # [ 0.705756] e1000: Intel(R) PRO/1000 Network Driver vm-test-run-secrets> machine # [ 0.705763] e1000: Copyright (c) 1999-2006 Intel Corporation. vm-test-run-secrets> machine # [ 0.705782] e1000e: Intel(R) PRO/1000 Network Driver vm-test-run-secrets> machine # [ 0.705787] e1000e: Copyright(c) 1999 - 2015 Intel Corporation. vm-test-run-secrets> machine # [ 0.705801] igb: Intel(R) Gigabit Ethernet Network Driver vm-test-run-secrets> machine # [ 0.705804] igb: Copyright (c) 2007-2014 Intel Corporation. vm-test-run-secrets> machine # [ 0.705815] igbvf: Intel(R) Gigabit Virtual Function Network Driver vm-test-run-secrets> machine # [ 0.705818] igbvf: Copyright (c) 2009 - 2012 Intel Corporation. vm-test-run-secrets> machine # [ 0.705911] sky2: driver version 1.30 vm-test-run-secrets> machine # [ 0.706718] usbcore: registered new interface driver usb-storage vm-test-run-secrets> machine # [ 0.706842] usbcore: registered new interface driver usbserial_generic vm-test-run-secrets> machine # [ 0.706863] usbserial: USB Serial support registered for generic vm-test-run-secrets> machine # [ 0.707150] hv_vmbus: registering driver hyperv_keyboard vm-test-run-secrets> machine # [ 0.708253] ehci-pci 0000:00:0a.0: EHCI Host Controller vm-test-run-secrets> machine # [ 0.708283] ehci-pci 0000:00:0a.0: new USB bus registered, assigned bus number 1 vm-test-run-secrets> machine # [ 0.708460] ehci-pci 0000:00:0a.0: irq 15, io mem 0x10089000 vm-test-run-secrets> machine # [ 0.716569] rtc-pl031 9010000.pl031: registered as rtc0 vm-test-run-secrets> machine # [ 0.716614] rtc-pl031 9010000.pl031: setting system clock to 2026-09-10T00:22:50 UTC (1788999770) vm-test-run-secrets> machine # [ 0.716836] i2c_dev: i2c /dev entries driver vm-test-run-secrets> machine # [ 0.719889] sdhci: Secure Digital Host Controller Interface driver vm-test-run-secrets> machine # [ 0.719902] sdhci: Copyright(c) Pierre Ossman vm-test-run-secrets> machine # [ 0.720033] Synopsys Designware Multimedia Card Interface Driver vm-test-run-secrets> machine # [ 0.720199] sdhci-pltfm: SDHCI platform and OF driver helper vm-test-run-secrets> machine # [ 0.721141] hid: raw HID events driver (C) Jiri Kosina vm-test-run-secrets> machine # [ 0.721288] usbcore: registered new interface driver usbhid vm-test-run-secrets> machine # [ 0.721293] usbhid: USB HID core driver vm-test-run-secrets> machine # [ 0.724849] ehci-pci 0000:00:0a.0: USB 2.0 started, EHCI 1.00 vm-test-run-secrets> machine # [ 0.725707] hub 1-0:1.0: USB hub found vm-test-run-secrets> machine # [ 0.726049] hub 1-0:1.0: 6 ports detected vm-test-run-secrets> machine # [ 0.726716] hw perfevents: enabled with armv8_pmuv3 PMU driver, 7 (0,8000003f) counters available vm-test-run-secrets> machine # [ 0.727547] drop_monitor: Initializing network drop monitor service vm-test-run-secrets> machine # [ 0.727688] NET: Registered PF_INET6 protocol family vm-test-run-secrets> machine # [ 0.730044] Segment Routing with IPv6 vm-test-run-secrets> machine # [ 0.730071] In-situ OAM (IOAM) with IPv6 vm-test-run-secrets> machine # [ 0.730139] NET: Registered PF_PACKET protocol family vm-test-run-secrets> machine # [ 0.731240] 9pnet: Installing 9P2000 support vm-test-run-secrets> machine # [ 0.733763] Key type dns_resolver registered vm-test-run-secrets> machine # [ 0.737021] registered taskstats version 1 vm-test-run-secrets> machine # [ 0.737174] Loading compiled-in X.509 certificates vm-test-run-secrets> machine # [ 0.742616] Demotion targets for Node 0: null vm-test-run-secrets> machine # [ 0.742710] Key type .fscrypt registered vm-test-run-secrets> machine # [ 0.742716] Key type fscrypt-provisioning registered vm-test-run-secrets> machine # [ 0.742825] ima: No TPM chip found, activating TPM-bypass! vm-test-run-secrets> machine # [ 0.742837] ima: Allocated hash algorithm: sha1 vm-test-run-secrets> machine # [ 0.742900] ima: No architecture policies found vm-test-run-secrets> machine # [ 0.745987] input: gpio-keys as /devices/platform/gpio-keys/input/input0 vm-test-run-secrets> machine # [ 0.756665] clk: Disabling unused clocks vm-test-run-secrets> machine # [ 0.756693] PM: genpd: Disabling unused power domains vm-test-run-secrets> machine # [ 0.760019] Freeing unused kernel memory: 4736K vm-test-run-secrets> machine # [ 0.760108] Run /init as init process vm-test-run-secrets> machine # [ 0.782517] systemd[1]: Successfully made /usr/ read-only. vm-test-run-secrets> machine # [ 0.971834] usb 1-1: new high-speed USB device number 2 using ehci-pci vm-test-run-secrets> machine # [ 1.117477] systemd[1]: systemd 260.2 running in system mode (+PAM +AUDIT -SELINUX +APPARMOR +IMA +IPE +SMACK +SECCOMP +GCRYPT -GNUTLS +OPENSSL +ACL +BLKID +CURL +ELFUTILS +FIDO2 +IDN2 +KMOD +LIBCRYPTSETUP +LIBCRYPTSETUP_PLUGINS +LIBFDISK +PCRE2 +PWQUALITY +P11KIT +QRENCODE +TPM2 +BZIP2 +LZ4 +XZ +ZLIB +ZSTD +BPF_FRAMEWORK -BTF -XKBCOMMON +UTMP +LIBARCHIVE) vm-test-run-secrets> machine # [ 1.125355] systemd[1]: Detected virtualization qemu. vm-test-run-secrets> machine # [ 1.126597] systemd[1]: Detected architecture arm64. vm-test-run-secrets> machine # [ 1.128300] systemd[1]: Running in initrd. vm-test-run-secrets> machine # [ 1.129322] systemd[1]: Initializing machine ID from random generator. vm-test-run-secrets> machine # [ 1.132836] systemd[1]: Hostname set to . vm-test-run-secrets> machine # [ 1.137383] input: QEMU QEMU USB Keyboard as /devices/platform/4010000000.pcie/pci0000:00/0000:00:0a.0/usb1/1-1/1-1:1.0/0003:0627:0001.0001/input/input1 vm-test-run-secrets> machine # [ 1.220013] hid-generic 0003:0627:0001.0001: input,hidraw0: USB HID v1.11 Keyboard [QEMU QEMU USB Keyboard] on usb-0000:00:0a.0-1/input0 vm-test-run-secrets> machine # [ 1.239990] systemd[1]: Queued start job for default target Initrd Default Target. vm-test-run-secrets> machine # [ 1.249324] systemd[1]: Created slice Slice /system/modprobe. vm-test-run-secrets> machine # [ 1.250090] systemd[1]: Started Dispatch Password Requests to Console Directory Watch. vm-test-run-secrets> machine # [ 1.250922] systemd[1]: Expecting device /dev/disk/by-label/nixos... vm-test-run-secrets> machine # [ 1.251554] systemd[1]: Reached target Path Units. vm-test-run-secrets> machine # [ 1.252066] systemd[1]: Reached target Slice Units. vm-test-run-secrets> machine # [ 1.252545] systemd[1]: Reached target Swaps. vm-test-run-secrets> machine # [ 1.253018] systemd[1]: Reached target Timer Units. vm-test-run-secrets> machine # [ 1.253654] systemd[1]: Listening on D-Bus System Message Bus Socket. vm-test-run-secrets> machine # [ 1.254467] systemd[1]: Listening on Journal Socket (/dev/log). vm-test-run-secrets> machine # [ 1.255553] systemd[1]: Listening on Journal Sockets. vm-test-run-secrets> machine # [ 1.256656] systemd[1]: Listening on udev Control Socket. vm-test-run-secrets> machine # [ 1.257722] systemd[1]: Listening on udev Kernel Socket. vm-test-run-secrets> machine # [ 1.258601] systemd[1]: Reached target Socket Units. vm-test-run-secrets> machine # [ 1.261101] systemd[1]: Starting Create List of Static Device Nodes... vm-test-run-secrets> machine # [ 1.271983] systemd[1]: Starting Load Kernel Module 9pnet_virtio... vm-test-run-secrets> machine # [ 1.272978] systemd[1]: Load Kernel Module configfs skipped, unmet condition check ConditionKernelModuleLoaded=!configfs vm-test-run-secrets> machine # [ 1.276085] systemd[1]: Mounting Kernel Configuration File System... vm-test-run-secrets> machine # [ 1.290097] systemd[1]: Starting Journal Service... vm-test-run-secrets> machine # [ 1.312002] systemd[1]: Starting Load Kernel Modules... vm-test-run-secrets> machine # [ 1.312076] systemd[1]: Early TPM SRK Setup skipped, unmet condition check ConditionSecurity=measured-uki vm-test-run-secrets> machine # [ 1.327989] systemd[1]: Starting Coldplug All udev Devices... vm-test-run-secrets> machine # [ 1.335917] systemd[1]: Finished Create List of Static Device Nodes. vm-test-run-secrets> machine # [ 1.337130] systemd[1]: modprobe@9pnet_virtio.service: Deactivated successfully. vm-test-run-secrets> machine # [ 1.337326] systemd[1]: Finished Load Kernel Module 9pnet_virtio. vm-test-run-secrets> machine # [ 1.340835] usb 1-2: new high-speed USB device number 3 using ehci-pci vm-test-run-secrets> machine # [ 1.344767] systemd-journald[73]: Collecting audit messages is disabled. vm-test-run-secrets> machine # [ 1.345432] systemd[1]: Starting Create Static Device Nodes in /dev gracefully... vm-test-run-secrets> machine # [ 1.346782] systemd[1]: Mounted Kernel Configuration File System. vm-test-run-secrets> machine # [ 1.388267] systemd[1]: Finished Create Static Device Nodes in /dev gracefully. vm-test-run-secrets> machine # [ 1.390037] systemd[1]: Starting Create Static Device Nodes in /dev... vm-test-run-secrets> machine # [ 1.397479] device-mapper: core: CONFIG_IMA_DISABLE_HTABLE is disabled. Duplicate IMA measurements will not be recorded in the IMA log. vm-test-run-secrets> machine # [ 1.412333] device-mapper: ioctl: 4.50.0-ioctl (2025-04-28) initialised: dm-devel@lists.linux.dev vm-test-run-secrets> machine # [ 1.420000] [drm] pci: virtio-gpu-pci detected at 0000:00:09.0 vm-test-run-secrets> machine # [ 1.420573] [drm] features: -virgl +edid -resource_blob -host_visible vm-test-run-secrets> machine # [ 1.420581] [drm] features: -context_init vm-test-run-secrets> machine # [ 1.421089] [drm] number of scanouts: 1 vm-test-run-secrets> machine # [ 1.421104] [drm] number of cap sets: 0 vm-test-run-secrets> machine # [ 1.440445] virtio-pci 0000:00:09.0: [drm] Registered 1 planes with drm panic vm-test-run-secrets> machine # [ 1.440465] [drm] Initialized virtio_gpu 0.1.0 for 0000:00:09.0 on minor 0 vm-test-run-secrets> machine # [ 1.445498] systemd[1]: Finished Create Static Device Nodes in /dev. vm-test-run-secrets> machine # [ 1.445724] systemd[1]: Reached target Preparation for Local File Systems. vm-test-run-secrets> machine # [ 1.445757] systemd[1]: Reached target Local File Systems. vm-test-run-secrets> machine # [ 1.442805] systemd-modules-load[74]: Inserted module 'dm_mod' vm-test-run-secrets> machine # [ 1.451454] systemd[1]: Starting Rule-based Manager for Device Events and Files... vm-test-run-secrets> machine # [ 1.452552] systemd[1]: Started Journal Service. vm-test-run-secrets> machine # [ 1.446158] systemd-modules-load[74]: Module 'virtio_balloon' is built in vm-test-run-secrets> machine # [ 1.446944] systemd-modules-load[74]: Module 'virtio_console' is built in vm-test-run-secrets> machine # [ 1.483905] Console: switching to colour frame buffer device 160x50 vm-test-run-secrets> machine # [ 1.484525] virtio-pci 0000:00:09.0: [drm] fb0: virtio_gpudrmfb frame buffer device vm-test-run-secrets> machine # [ 1.471916] systemd[1]: Starting Create System Files and Directories... vm-test-run-secrets> machine # [ 1.486598] systemd-modules-load[74]: Inserted module 'virtio_gpu' vm-test-run-secrets> machine # [ 1.487458] systemd-modules-load[74]: Module 'virtio_rng' is built in vm-test-run-secrets> machine # [ 1.492578] systemd[1]: Finished Load Kernel Modules. vm-test-run-secrets> machine # [ 1.503392] input: QEMU QEMU USB Tablet as /devices/platform/4010000000.pcie/pci0000:00/0000:00:0a.0/usb1/1-2/1-2:1.0/0003:0627:0001.0002/input/input2 vm-test-run-secrets> machine # [ 1.503581] hid-generic 0003:0627:0001.0002: input,hidraw1: USB HID v0.01 Mouse [QEMU QEMU USB Tablet] on usb-0000:00:0a.0-2/input0 vm-test-run-secrets> machine # [ 1.528544] systemd[1]: Starting Apply Kernel Variables... vm-test-run-secrets> machine # [ 1.537221] systemd[1]: Finished Create System Files and Directories. vm-test-run-secrets> machine # [ 1.549666] systemd[1]: Finished Apply Kernel Variables. vm-test-run-secrets> machine # [ 1.551566] systemd-udevd[81]: Using default interface naming scheme 'v260'. vm-test-run-secrets> machine # [ 1.576921] systemd[1]: Started Rule-based Manager for Device Events and Files. vm-test-run-secrets> machine # [ 1.640131] systemd[1]: Starting Virtual Console Setup... vm-test-run-secrets> machine # [ 1.688477] systemd-vconsole-setup[104]: Configuration of first virtual console was skipped, ignoring remaining ones. vm-test-run-secrets> machine # [ 1.690979] systemd[1]: Finished Virtual Console Setup. vm-test-run-secrets> machine # [ 1.961822] systemd[1]: Finished Coldplug All udev Devices. vm-test-run-secrets> machine # [ 1.962423] systemd[1]: Reached target System Initialization. vm-test-run-secrets> machine # [ 1.962916] systemd[1]: Reached target Basic System. vm-test-run-secrets> machine # [ 2.078596] (udev-worker)[94]: Network interface NamePolicy= disabled on kernel command line. vm-test-run-secrets> machine # [ 2.094944] (udev-worker)[96]: Network interface NamePolicy= disabled on kernel command line. vm-test-run-secrets> machine # [ 2.133299] systemd[1]: Found device /dev/disk/by-label/nixos. vm-test-run-secrets> machine # [ 2.136428] systemd[1]: Reached target Initrd Root Device. vm-test-run-secrets> machine # [ 2.139850] systemd[1]: Starting File System Check on /dev/disk/by-label/nixos... vm-test-run-secrets> machine # [ 2.189632] systemd-fsck[113]: nixos: clean, 12/65536 files, 13019/262144 blocks vm-test-run-secrets> machine # [ 2.193871] systemd[1]: Finished File System Check on /dev/disk/by-label/nixos. vm-test-run-secrets> machine # [ 2.323399] systemd[1]: Mounting /sysroot... vm-test-run-secrets> machine # [ 2.357859] EXT4-fs (vda): mounted filesystem 1dd9c7ad-3402-4b55-9721-0d7eaa07e7da r/w with ordered data mode. Quota mode: none. vm-test-run-secrets> machine # [ 2.354039] systemd[1]: Mounted /sysroot. vm-test-run-secrets> machine # [ 2.355381] systemd[1]: Reached target Initrd Root File System. vm-test-run-secrets> machine # [ 2.356284] systemd[1]: Starting Mountpoints Configured in the Real Root... vm-test-run-secrets> machine # [ 2.379021] systemd-sysroot-fstab-check[121]: /sysroot should be mounted in the initrd, will request daemon-reload. vm-test-run-secrets> machine # [ 2.384426] systemd[1]: Reload requested from client PID 121 ('systemd-sysroot') (unit initrd-parse-etc.service)... vm-test-run-secrets> machine # [ 2.386292] systemd[1]: Reloading... vm-test-run-secrets> machine # [ 2.568098] systemd[1]: Reloading finished in 183 ms. vm-test-run-secrets> machine # [ 2.575778] systemd-sysroot-fstab-check[121]: Requesting initrd-fs.target/start/replace... vm-test-run-secrets> machine # [ 2.578470] systemd-sysroot-fstab-check[121]: Requesting swap.target/start/replace... vm-test-run-secrets> machine # [ 2.580381] systemd[1]: Starting Load Kernel Module 9pnet_virtio... vm-test-run-secrets> machine # [ 2.588888] systemd[1]: initrd-parse-etc.service: Deactivated successfully. vm-test-run-secrets> machine # [ 2.590161] systemd[1]: Finished Mountpoints Configured in the Real Root. vm-test-run-secrets> machine # [ 2.592071] systemd[1]: initrd-parse-etc.service: Triggering OnSuccess= dependencies. vm-test-run-secrets> machine # [ 2.608416] systemd[1]: modprobe@9pnet_virtio.service: Deactivated successfully. vm-test-run-secrets> machine # [ 2.609385] systemd[1]: Finished Load Kernel Module 9pnet_virtio. vm-test-run-secrets> machine # [ 3.011713] (udev-worker)[98]: mtd0ro: Failed to find and pin callout binary "/nix/store/x8r7i65cbx5zbf8f0dmnvwrm00r5ild8-systemd-260.2/lib/udev/mtd_probe": No such file or directory vm-test-run-secrets> machine # [ 3.016162] (udev-worker)[98]: mtd0ro: /nix/store/x8r7i65cbx5zbf8f0dmnvwrm00r5ild8-systemd-260.2/lib/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 directory vm-test-run-secrets> machine # [ 3.034724] systemd[1]: systemd-vconsole-setup.service: Deactivated successfully. vm-test-run-secrets> machine # [ 3.037474] systemd[1]: Stopped Virtual Console Setup. vm-test-run-secrets> machine # [ 3.038072] systemd[1]: Stopping Virtual Console Setup... vm-test-run-secrets> machine # [ 3.040132] systemd[1]: Starting Virtual Console Setup... vm-test-run-secrets> machine # [ 3.056869] systemd[1]: systemd-vconsole-setup.service: Deactivated successfully. vm-test-run-secrets> machine # [ 3.058495] systemd[1]: Stopped Virtual Console Setup. vm-test-run-secrets> machine # [ 3.060228] systemd[1]: Starting Virtual Console Setup... vm-test-run-secrets> machine # [ 3.075000] systemd-vconsole-setup[144]: Configuration of first virtual console was skipped, ignoring remaining ones. vm-test-run-secrets> machine # [ 3.077616] systemd[1]: Finished Virtual Console Setup. vm-test-run-secrets> machine # [ 3.324874] systemd[1]: Mounting /sysroot/nix/.ro-store... vm-test-run-secrets> machine # [ 3.333399] systemd[1]: Mounting /sysroot/nix/.rw-store... vm-test-run-secrets> machine # [ 3.340379] systemd[1]: Mounting /sysroot/run... vm-test-run-secrets> machine # [ 3.348740] systemd[1]: Mounting /sysroot/tmp/shared... vm-test-run-secrets> machine # [ 3.364617] systemd[1]: Mounting /sysroot/tmp/xchg... vm-test-run-secrets> machine # [ 3.369804] systemd[1]: Mounted /sysroot/nix/.rw-store. vm-test-run-secrets> machine # [ 3.383018] systemd[1]: Starting rw-sysroot-nix-store.service... vm-test-run-secrets> machine # [ 3.383900] systemd[1]: Mounted /sysroot/nix/.ro-store. vm-test-run-secrets> machine # [ 3.384816] systemd[1]: Mounted /sysroot/run. vm-test-run-secrets> machine # [ 3.403083] systemd[1]: Mounted /sysroot/tmp/xchg. vm-test-run-secrets> machine # [ 3.405670] systemd[1]: Mounted /sysroot/tmp/shared. vm-test-run-secrets> machine # [ 3.418336] systemd[1]: rw-sysroot-nix-store.service: Deactivated successfully. vm-test-run-secrets> machine # [ 3.419558] systemd[1]: Finished rw-sysroot-nix-store.service. vm-test-run-secrets> machine # [ 3.421882] systemd[1]: Mounting /sysroot/nix/store... vm-test-run-secrets> machine # [ 3.451761] systemd[1]: Mounted /sysroot/nix/store. vm-test-run-secrets> machine # [ 3.453227] systemd[1]: Reached target Initrd File Systems. vm-test-run-secrets> machine # [ 3.455464] systemd[1]: Starting Find NixOS closure... vm-test-run-secrets> machine # [ 3.464331] systemd[1]: Starting Create Volatile Files and Directories in the Real Root... vm-test-run-secrets> machine # [ 3.485613] systemd[1]: Finished Create Volatile Files and Directories in the Real Root. vm-test-run-secrets> machine # [ 3.499476] systemd[1]: Finished Find NixOS closure. vm-test-run-secrets> machine # [ 3.500848] systemd[1]: Reached target Initrd Default Target. vm-test-run-secrets> machine # [ 3.502961] systemd[1]: Starting Cleaning Up and Shutting Down Daemons... vm-test-run-secrets> machine # [ 3.528500] systemd[1]: Stopped target Initrd Default Target. vm-test-run-secrets> machine # [ 3.529691] systemd[1]: Stopped target Basic System. vm-test-run-secrets> machine # [ 3.532086] systemd[1]: Stopped target Initrd Root Device. vm-test-run-secrets> machine # [ 3.532901] systemd[1]: Stopped target Path Units. vm-test-run-secrets> machine # [ 3.533436] systemd[1]: systemd-ask-password-console.path: Deactivated successfully. vm-test-run-secrets> machine # [ 3.534711] systemd[1]: Stopped Dispatch Password Requests to Console Directory Watch. vm-test-run-secrets> machine # [ 3.536698] systemd[1]: Stopped target Slice Units. vm-test-run-secrets> machine # [ 3.537418] systemd[1]: Stopped target Socket Units. vm-test-run-secrets> machine # [ 3.539113] systemd[1]: Stopped target System Initialization. vm-test-run-secrets> machine # [ 3.540106] systemd[1]: Stopped target Swaps. vm-test-run-secrets> machine # [ 3.544347] systemd[1]: Stopped target Timer Units. vm-test-run-secrets> machine # [ 3.544918] systemd[1]: dbus.socket: Deactivated successfully. vm-test-run-secrets> machine # [ 3.545441] systemd[1]: Closed D-Bus System Message Bus Socket. vm-test-run-secrets> machine # [ 3.545964] systemd[1]: initrd-find-nixos-closure.service: Deactivated successfully. vm-test-run-secrets> machine # [ 3.546672] systemd[1]: Stopped Find NixOS closure. vm-test-run-secrets> machine # [ 3.547285] systemd[1]: Starting Load Kernel Module 9pnet_virtio... vm-test-run-secrets> machine # [ 3.551913] systemd[1]: Starting rw-sysroot-nix-store.service... vm-test-run-secrets> machine # [ 3.553523] systemd[1]: systemd-sysctl.service: Deactivated successfully. vm-test-run-secrets> machine # [ 3.555108] systemd[1]: Stopped Apply Kernel Variables. vm-test-run-secrets> machine # [ 3.556379] systemd[1]: systemd-modules-load.service: Deactivated successfully. vm-test-run-secrets> machine # [ 3.560485] systemd[1]: Stopped Load Kernel Modules. vm-test-run-secrets> machine # [ 3.562626] systemd[1]: systemd-tmpfiles-setup-sysroot.service: Deactivated successfully. vm-test-run-secrets> machine # [ 3.563948] systemd[1]: Stopped Create Volatile Files and Directories in the Real Root. vm-test-run-secrets> machine # [ 3.567153] systemd[1]: systemd-tmpfiles-setup.service: Deactivated successfully. vm-test-run-secrets> machine # [ 3.567767] systemd[1]: Stopped Create System Files and Directories. vm-test-run-secrets> machine # [ 3.571028] systemd[1]: Stopped target Local File Systems. vm-test-run-secrets> machine # [ 3.571529] systemd[1]: Stopped target Preparation for Local File Systems. vm-test-run-secrets> machine # [ 3.574134] systemd[1]: systemd-udev-trigger.service: Deactivated successfully. vm-test-run-secrets> machine # [ 3.574846] systemd[1]: Stopped Coldplug All udev Devices. vm-test-run-secrets> machine # [ 3.575407] systemd[1]: Stopping Rule-based Manager for Device Events and Files... vm-test-run-secrets> machine # [ 3.576123] systemd[1]: systemd-vconsole-setup.service: Deactivated successfully. vm-test-run-secrets> machine # [ 3.576740] systemd[1]: Stopped Virtual Console Setup. vm-test-run-secrets> machine # [ 3.577171] systemd[1]: initrd-cleanup.service: Deactivated successfully. vm-test-run-secrets> machine # [ 3.588135] systemd[1]: Finished Cleaning Up and Shutting Down Daemons. vm-test-run-secrets> machine # [ 3.588896] systemd[1]: systemd-udevd.service: Deactivated successfully. vm-test-run-secrets> machine # [ 3.589437] systemd[1]: Stopped Rule-based Manager for Device Events and Files. vm-test-run-secrets> machine # [ 3.590000] systemd[1]: systemd-udevd.service: Consumed 1.001s CPU time over 2.143s wall clock time, 22.7M memory peak. vm-test-run-secrets> machine # [ 3.593529] systemd[1]: modprobe@9pnet_virtio.service: Deactivated successfully. vm-test-run-secrets> machine # [ 3.594229] systemd[1]: Finished Load Kernel Module 9pnet_virtio. vm-test-run-secrets> machine # [ 3.595711] systemd[1]: rw-sysroot-nix-store.service: Deactivated successfully. vm-test-run-secrets> machine # [ 3.597432] systemd[1]: Finished rw-sysroot-nix-store.service. vm-test-run-secrets> machine # [ 3.599409] systemd[1]: systemd-udevd-control.socket: Deactivated successfully. vm-test-run-secrets> machine # [ 3.600368] systemd[1]: Closed udev Control Socket. vm-test-run-secrets> machine # [ 3.601576] systemd[1]: Starting Cleanup udev Database... vm-test-run-secrets> machine # [ 3.604232] systemd[1]: systemd-tmpfiles-setup-dev.service: Deactivated successfully. vm-test-run-secrets> machine # [ 3.604934] systemd[1]: Stopped Create Static Device Nodes in /dev. vm-test-run-secrets> machine # [ 3.605480] systemd[1]: systemd-tmpfiles-setup-dev-early.service: Deactivated successfully. vm-test-run-secrets> machine # [ 3.608202] systemd[1]: Stopped Create Static Device Nodes in /dev gracefully. vm-test-run-secrets> machine # [ 3.608867] systemd[1]: kmod-static-nodes.service: Deactivated successfully. vm-test-run-secrets> machine # [ 3.609441] systemd[1]: Stopped Create List of Static Device Nodes. vm-test-run-secrets> machine # [ 3.633886] systemd[1]: initrd-udevadm-cleanup-db.service: Deactivated successfully. vm-test-run-secrets> machine # [ 3.634956] systemd[1]: Finished Cleanup udev Database. vm-test-run-secrets> machine # [ 3.636924] systemd[1]: Reached target Switch Root. vm-test-run-secrets> machine # [ 3.638686] systemd[1]: Starting NixOS Activation... vm-test-run-secrets> machine # [ 3.809615] initrd-nixos-activation-start[181]: booting system configuration /nix/store/pnyfmszz583g38jjwfizdmqkr2qdg0cl-nixos-system-machine-test vm-test-run-secrets> machine # [ 3.878820] initrd-nixos-activation-start[181]: running activation script... vm-test-run-secrets> machine # [ 4.290727] initrd-nixos-activation-start[204]: setting up /etc... vm-test-run-secrets> machine # [ 4.532577] initrd-nixos-activation-start[204]: setting up secrets... vm-test-run-secrets> machine # [ 4.875346] systemd[1]: initrd-nixos-activation.service: Deactivated successfully. vm-test-run-secrets> machine # [ 4.877321] systemd[1]: Finished NixOS Activation. vm-test-run-secrets> machine # [ 4.878096] systemd[1]: Starting Switch Root... vm-test-run-secrets> machine # [ 4.893392] systemd[1]: Switching root. vm-test-run-secrets> machine # [ 4.961716] systemd-journald[73]: Received SIGTERM from PID 1 (systemd). vm-test-run-secrets> machine # [ 5.513107] systemd[1]: systemd 260.2 running in system mode (+PAM +AUDIT -SELINUX +APPARMOR +IMA +IPE +SMACK +SECCOMP +GCRYPT -GNUTLS +OPENSSL +ACL +BLKID +CURL +ELFUTILS +FIDO2 +IDN2 +KMOD +LIBCRYPTSETUP +LIBCRYPTSETUP_PLUGINS +LIBFDISK +PCRE2 +PWQUALITY +P11KIT +QRENCODE +TPM2 +BZIP2 +LZ4 +XZ +ZLIB +ZSTD +BPF_FRAMEWORK -BTF -XKBCOMMON +UTMP +LIBARCHIVE) vm-test-run-secrets> machine # [ 5.513161] systemd[1]: Detected virtualization qemu. vm-test-run-secrets> machine # [ 5.513194] systemd[1]: Detected architecture arm64. vm-test-run-secrets> machine # [ 5.513272] systemd[1]: Detected first boot. vm-test-run-secrets> machine # [ 5.520729] systemd[1]: Initializing machine ID from random generator. vm-test-run-secrets> machine # [ 5.774274] systemd[1]: bpf-restrict-fs: LSM BPF program attached vm-test-run-secrets> machine # [ 5.936647] systemd[1]: Applying preset policy. vm-test-run-secrets> machine # [ 6.330743] systemd[1]: Populated /etc with preset unit settings. vm-test-run-secrets> machine # [ 6.749984] systemd[1]: initrd-switch-root.service: Deactivated successfully. vm-test-run-secrets> machine # [ 6.750920] systemd[1]: Stopped initrd-switch-root.service. vm-test-run-secrets> machine # [ 6.752926] systemd[1]: systemd-journald.service: Scheduled restart job, restart counter is at 1. vm-test-run-secrets> machine # [ 6.754834] systemd[1]: Created slice Slice /system/getty. vm-test-run-secrets> machine # [ 6.756119] systemd[1]: Created slice User and Session Slice. vm-test-run-secrets> machine # [ 6.757179] systemd[1]: Started Dispatch Password Requests to Console Directory Watch. vm-test-run-secrets> machine # [ 6.758432] systemd[1]: Started Forward Password Requests to Wall Directory Watch. vm-test-run-secrets> machine # [ 6.760185] systemd[1]: Expecting device /dev/hvc0... vm-test-run-secrets> machine # [ 6.761202] systemd[1]: Expecting device /dev/ttyAMA0... vm-test-run-secrets> machine # [ 6.762531] systemd[1]: Reached target Local Encrypted Volumes. vm-test-run-secrets> machine # [ 6.763569] systemd[1]: Stopped target initrd-fs.target. vm-test-run-secrets> machine # [ 6.764623] systemd[1]: Stopped target initrd-root-fs.target. vm-test-run-secrets> machine # [ 6.765594] systemd[1]: Stopped target initrd-switch-root.target. vm-test-run-secrets> machine # [ 6.767095] systemd[1]: Reached target Virtual Machines and Containers. vm-test-run-secrets> machine # [ 6.768713] systemd[1]: Reached target Path Units. vm-test-run-secrets> machine # [ 6.769616] systemd[1]: Reached target Remote File Systems. vm-test-run-secrets> machine # [ 6.771450] systemd[1]: Reached target Slice Units. vm-test-run-secrets> machine # [ 6.773039] systemd[1]: Reached target Swaps. vm-test-run-secrets> machine # [ 6.778055] systemd[1]: Listening on Process Core Dump Socket. vm-test-run-secrets> machine # [ 6.781184] systemd[1]: Listening on Credential Encryption/Decryption. vm-test-run-secrets> machine # [ 6.785132] systemd[1]: Starting Journal Log Access Socket... vm-test-run-secrets> machine # [ 6.786909] systemd[1]: Listening on Journal Audit Socket. vm-test-run-secrets> machine # [ 6.788590] systemd[1]: Listening on Network Management Metrics Varlink Socket. vm-test-run-secrets> machine # [ 6.790213] systemd[1]: Listening on Network Management Netlink Socket. vm-test-run-secrets> machine # [ 6.792058] systemd[1]: Listening on Userspace Out-Of-Memory (OOM) Killer Socket. vm-test-run-secrets> machine # [ 6.793531] systemd[1]: Make TPM PCR Policy skipped, unmet condition check ConditionSecurity=measured-uki vm-test-run-secrets> machine # [ 6.795331] systemd[1]: Listening on udev Control Socket. vm-test-run-secrets> machine # [ 6.799510] systemd[1]: Mounting Huge Pages File System... vm-test-run-secrets> machine # [ 6.803255] systemd[1]: Mounting POSIX Message Queue File System... vm-test-run-secrets> machine # [ 6.809531] systemd[1]: Mounting Kernel Debug File System... vm-test-run-secrets> machine # [ 6.817587] systemd[1]: Mounting Kernel Trace File System... vm-test-run-secrets> machine # [ 6.834315] systemd[1]: Starting Create List of Static Device Nodes... vm-test-run-secrets> machine # [ 6.840730] systemd[1]: Starting Load Kernel Module 9pnet_virtio... vm-test-run-secrets> machine # [ 6.842140] systemd[1]: Load Kernel Module configfs skipped, unmet condition check ConditionKernelModuleLoaded=!configfs vm-test-run-secrets> machine # [ 6.851692] systemd[1]: Mounting Kernel Configuration File System... vm-test-run-secrets> machine # [ 6.855948] systemd[1]: Load Kernel Module drm skipped, unmet condition check ConditionKernelModuleLoaded=!drm vm-test-run-secrets> machine # [ 6.859386] systemd[1]: Load Kernel Module efi_pstore skipped, unmet condition check ConditionKernelModuleLoaded=!efi_pstore vm-test-run-secrets> machine # [ 6.875573] systemd[1]: Starting Load Kernel Module fuse... vm-test-run-secrets> machine # [ 6.878283] systemd[1]: Clear Stale Hibernate Storage Info skipped, unmet condition check ConditionPathExists=/sys/firmware/efi/efivars/HibernateLocation-8cf2644b-4b0b-428f-9387-6d876050dc67 vm-test-run-secrets> machine # [ 6.945333] systemd[1]: Starting Journal Service... vm-test-run-secrets> machine # [ 6.976186] systemd[1]: Starting Load Kernel Modules... vm-test-run-secrets> machine # [ 6.992294] systemd[1]: Starting Userspace Out-Of-Memory (OOM) Killer... vm-test-run-secrets> machine # [ 7.016809] systemd[1]: Starting Remount Root and Kernel File Systems... vm-test-run-secrets> machine # [ 7.022671] systemd[1]: Early TPM SRK Setup skipped, unmet condition check ConditionSecurity=measured-uki vm-test-run-secrets> machine # [ 7.049559] systemd[1]: Starting Coldplug All udev Devices... vm-test-run-secrets> machine # [ 7.066107] systemd[1]: Listening on Journal Log Access Socket. vm-test-run-secrets> machine # [ 7.071707] fuse: init (API version 7.45) vm-test-run-secrets> machine # [ 7.074379] systemd[1]: Mounted Huge Pages File System. vm-test-run-secrets> machine # [ 7.081907] systemd[1]: Mounted POSIX Message Queue File System. vm-test-run-secrets> machine # [ 7.085861] systemd[1]: Mounted Kernel Debug File System. vm-test-run-secrets> machine # [ 7.090337] systemd[1]: Mounted Kernel Trace File System. vm-test-run-secrets> machine # [ 7.097989] systemd[1]: Finished Create List of Static Device Nodes. vm-test-run-secrets> machine # [ 7.104285] systemd[1]: modprobe@9pnet_virtio.service: Deactivated successfully. vm-test-run-secrets> machine # [ 7.109763] systemd-journald[279]: Collecting audit messages is enabled. vm-test-run-secrets> machine # [ 7.114063] systemd[1]: Finished Load Kernel Module 9pnet_virtio. vm-test-run-secrets> machine # [ 7.114773] systemd[1]: Mounted Kernel Configuration File System. vm-test-run-secrets> machine # [ 7.115270] systemd[1]: modprobe@fuse.service: Deactivated successfully. vm-test-run-secrets> machine # [ 7.122028] systemd[1]: Finished Load Kernel Module fuse. vm-test-run-secrets> machine # [ 7.122047] systemd[1]: Queued start job for default target Multi-User System. vm-test-run-secrets> machine # [ 7.124323] systemd[1]: systemd-journald.service: Deactivated successfully. vm-test-run-secrets> machine # [ 7.133633] systemd[1]: Finished Load Kernel Modules. vm-test-run-secrets> machine # [ 7.134785] systemd[1]: Started Journal Service. vm-test-run-secrets> machine # [ 7.130073] systemd-modules-load[280]: Module 'atkbd' is built in vm-test-run-secrets> machine # [ 7.134615] systemd-modules-load[280]: Module 'loop' is built in vm-test-run-secrets> machine # [ 7.155128] systemd[1]: Mounting FUSE Control File System... vm-test-run-secrets> machine # [ 7.163913] EXT4-fs (vda): re-mounted 1dd9c7ad-3402-4b55-9721-0d7eaa07e7da. vm-test-run-secrets> machine # [ 7.164774] systemd[1]: Starting Firewall... vm-test-run-secrets> machine # [ 7.180547] systemd[1]: Starting Apply Kernel Variables... vm-test-run-secrets> machine # [ 7.195163] systemd[1]: Starting Create Static Device Nodes in /dev gracefully... vm-test-run-secrets> machine # [ 7.213240] systemd-oomd[281]: No swap; memory pressure usage will be degraded vm-test-run-secrets> machine # [ 7.223249] systemd[1]: Started Userspace Out-Of-Memory (OOM) Killer. vm-test-run-secrets> machine # [ 7.230677] systemd[1]: Finished Remount Root and Kernel File Systems. vm-test-run-secrets> machine # [ 7.251308] systemd[1]: Starting Flush Journal to Persistent Storage... vm-test-run-secrets> machine # [ 7.260213] systemd[1]: Platform Persistent Storage Archival skipped, unmet condition check ConditionDirectoryNotEmpty=/sys/fs/pstore vm-test-run-secrets> machine # [ 7.266778] systemd[1]: Starting Load/Save OS Random Seed... vm-test-run-secrets> machine # [ 7.272770] systemd[1]: TPM SRK Setup skipped, unmet condition check ConditionSecurity=measured-uki vm-test-run-secrets> machine # [ 7.325854] systemd[1]: Mounted FUSE Control File System. vm-test-run-secrets> machine # [ 7.364524] systemd[1]: Finished Apply Kernel Variables. vm-test-run-secrets> machine # [ 7.380710] systemd-journald[279]: Received client request to flush runtime journal. vm-test-run-secrets> machine # [ 7.510133] systemd[1]: Starting Network Name Resolution... vm-test-run-secrets> machine # [ 7.514441] systemd[1]: Finished Create Static Device Nodes in /dev gracefully. vm-test-run-secrets> machine # [ 7.524406] systemd[1]: Starting Create Static Device Nodes in /dev... vm-test-run-secrets> machine # [ 7.525035] systemd[1]: Finished Load/Save OS Random Seed. vm-test-run-secrets> machine # [ 7.525522] systemd[1]: Reached target First Boot Complete. vm-test-run-secrets> machine # [ 7.526018] systemd[1]: Finished Flush Journal to Persistent Storage. vm-test-run-secrets> machine # [ 7.563726] systemd-resolved[309]: Positive Trust Anchors: vm-test-run-secrets> machine # [ 7.565904] systemd-resolved[309]: . IN DS 20326 8 2 e06d44b80b8f1d39a95c0b0d7c65d08458e880409bbc683457104237c7f8ec8d vm-test-run-secrets> machine # [ 7.571568] systemd-resolved[309]: . IN DS 38696 8 2 683d2d0acb8c9b712a1948b27f741219298d0a450d612c483af444a4c0fb2b16 vm-test-run-secrets> machine # [ 7.579949] systemd-resolved[309]: Negative trust anchors: home.arpa 10.in-addr.arpa 16.172.in-addr.arpa 17.172.in-addr.arpa 18.172.in-addr.arpa 19.172.in-addr.arpa 20.172.in-addr.arpa 21.172.in-addr.arpa 22.172.in-addr.arpa 23.172.in-addr.arpa 24.172.in-addr.arpa 25.172.in-addr.arpa 26.172.in-addr.arpa 27.172.in-addr.arpa 28.172.in-addr.arpa 29.172.in-addr.arpa 30.172.in-addr.arpa 31.172.in-addr.arpa 170.0.0.192.in-addr.arpa 171.0.0.192.in-addr.arpa 168.192.in-addr.arpa d.f.ip6.arpa ipv4only.arpa resolver.arpa corp home internal intranet lan local private test vm-test-run-secrets> machine # [ 7.612674] systemd[1]: Finished Create Static Device Nodes in /dev. vm-test-run-secrets> machine # [ 7.616941] systemd[1]: Reached target Preparation for Local File Systems. vm-test-run-secrets> machine # [ 7.618970] systemd[1]: Starting Rule-based Manager for Device Events and Files... vm-test-run-secrets> machine # [ 7.701469] systemd-udevd[323]: Using default interface naming scheme 'v260'. vm-test-run-secrets> machine # [ 7.754205] systemd[1]: Mounting /run/wrappers... vm-test-run-secrets> machine # [ 7.826233] systemd[1]: Mounted /run/wrappers. vm-test-run-secrets> machine # [ 7.827594] systemd[1]: Reached target Local File Systems. vm-test-run-secrets> machine # [ 7.828899] systemd-resolved[309]: Using system hostname 'machine'. vm-test-run-secrets> machine # [ 7.835179] systemd[1]: Listening on Boot Loader Control Service Socket. vm-test-run-secrets> machine # [ 7.843532] systemd[1]: Starting register-nix-paths.service... vm-test-run-secrets> machine # [ 7.846661] systemd[1]: Starting Create SUID/SGID Wrappers... vm-test-run-secrets> machine # [ 7.847666] systemd[1]: Update Boot Loader Random Seed skipped, no trigger condition checks were met. vm-test-run-secrets> machine # [ 7.851371] systemd[1]: Starting Save Transient machine-id to Disk... vm-test-run-secrets> machine # [ 7.868203] systemd[1]: Starting Create System Files and Directories... vm-test-run-secrets> machine # [ 7.870212] systemd[1]: Started Network Name Resolution. vm-test-run-secrets> machine # [ 8.010639] systemd[1]: Started Rule-based Manager for Device Events and Files. vm-test-run-secrets> machine # [ 8.105137] systemd[1]: Finished Create System Files and Directories. vm-test-run-secrets> machine # [ 8.115099] systemd[1]: Starting Rebuild Journal Catalog... vm-test-run-secrets> machine # [ 8.127237] systemd[1]: Starting Record System Boot/Shutdown in UTMP... vm-test-run-secrets> machine # [ 8.180918] systemd[1]: etc-machine\x2did.mount: Deactivated successfully. vm-test-run-secrets> machine # [ 8.206174] systemd[1]: Finished Save Transient machine-id to Disk. vm-test-run-secrets> machine # [ 8.280595] systemd[1]: Finished Record System Boot/Shutdown in UTMP. vm-test-run-secrets> machine # [ 8.363373] systemd[1]: Finished Rebuild Journal Catalog. vm-test-run-secrets> machine # [ 8.374789] systemd[1]: Starting Update is Completed... vm-test-run-secrets> machine # [ 8.465852] systemd[1]: Finished Update is Completed. vm-test-run-secrets> machine # [ 8.496246] systemd[1]: Finished Coldplug All udev Devices. vm-test-run-secrets> machine # [ 8.666264] systemd[1]: Load Kernel Module configfs skipped, unmet condition check ConditionKernelModuleLoaded=!configfs vm-test-run-secrets> machine # [ 8.978479] systemd[1]: suid-sgid-wrappers.service: Deactivated successfully. vm-test-run-secrets> machine # [ 8.981966] systemd[1]: Finished Create SUID/SGID Wrappers. vm-test-run-secrets> machine # [ 8.992827] systemd[1]: Condition check resulted in /dev/hvc0 being skipped. vm-test-run-secrets> machine # [ 9.031068] systemd[1]: Condition check resulted in /dev/ttyAMA0 being skipped. vm-test-run-secrets> machine # [ 9.279365] systemd[1]: Finished Firewall. vm-test-run-secrets> machine # [ 9.281377] systemd[1]: Reached target Preparation for Network. vm-test-run-secrets> machine # [ 9.287190] systemd[1]: Starting Network Management... vm-test-run-secrets> machine # [ 9.305135] systemd[1]: Finished register-nix-paths.service. vm-test-run-secrets> machine # [ 9.305772] systemd[1]: Reached target System Initialization. vm-test-run-secrets> machine # [ 9.308263] systemd[1]: Started Discard unused filesystem blocks once a week. vm-test-run-secrets> machine # [ 9.312212] systemd[1]: Started Daily Cleanup of Temporary Directories. vm-test-run-secrets> machine # [ 9.312867] systemd[1]: Reached target Timer Units. vm-test-run-secrets> machine # [ 9.314550] systemd[1]: Listening on D-Bus System Message Bus Socket. vm-test-run-secrets> machine # [ 9.315967] systemd[1]: Listening on Nix Daemon Socket. vm-test-run-secrets> machine # [ 9.318319] systemd[1]: Listening on Hostname Service Socket. vm-test-run-secrets> machine # [ 9.319763] systemd[1]: Reached target Socket Units. vm-test-run-secrets> machine # [ 9.323826] systemd[1]: Reached target Basic System. vm-test-run-secrets> machine # [ 9.326794] systemd[1]: Started backdoor.service. vm-test-run-secrets> machine # [ 9.329186] systemd[1]: Starting Import lastlog data into lastlog2 database... vm-test-run-secrets> machine # [ 9.340836] systemd[1]: Starting Name Service Cache Daemon (nsncd)... vm-test-run-secrets> machine # [ 9.367552] systemd[1]: Starting Post-Boot Actions... vm-test-run-secrets> machine # [ 9.391298] systemd[1]: Started Reset console on configuration changes. vm-test-run-secrets> machine # [ 9.435912] (udev-worker)[363]: Network interface NamePolicy= disabled on kernel command line. vm-test-run-secrets> machine # [ 9.441917] (udev-worker)[360]: Network interface NamePolicy= disabled on kernel command line. vm-test-run-secrets> machine # connecting to host... vm-test-run-secrets> machine # [ 9.533799] systemd[1]: Starting D-Bus System Message Bus... vm-test-run-secrets> machine: Guest shell says: b'Spawning backdoor root shell...\n' vm-test-run-secrets> machine: connected to guest root shell vm-test-run-secrets> machine: (connecting took 9.82 seconds) vm-test-run-secrets> machine: (finished: waiting for the VM to finish booting, in 10.22 seconds) vm-test-run-secrets> machine # [ 9.580577] systemd[1]: Finished Post-Boot Actions. vm-test-run-secrets> machine # [ 9.588245] systemd[1]: Finished Import lastlog data into lastlog2 database. vm-test-run-secrets> machine # [ 9.603450] nsncd[509]: Sep 10 00:22:59.392 INFO started, config: Config { ignored_request_types: {}, worker_count: 8, handoff_timeout: 10s }, path: "/var/run/nscd/socket" vm-test-run-secrets> machine # [ 9.613901] systemd[1]: Started Name Service Cache Daemon (nsncd). vm-test-run-secrets> machine # [ 9.614505] systemd[1]: Reached target Host and Network Name Lookups. vm-test-run-secrets> machine # [ 9.615027] systemd[1]: Reached target User and Group Name Lookups. vm-test-run-secrets> machine # [ 9.630941] systemd[1]: Starting User Login Management... vm-test-run-secrets> machine: (finished: must succeed: cat /etc/secret >&2, in 10.35 seconds) vm-test-run-secrets> machine: must succeed: cat /etc/group-secret >&2 vm-test-run-secrets> machine # foo[ 9.689238] cfg80211: Loading compiled-in X.509 certificates for regulatory database vm-test-run-secrets> machine # [ 9.737608] Loaded X.509 cert 'sforshee: 00b28ddf47aef9cea7' vm-test-run-secrets> machine # [ 9.738145] Loaded X.509 cert 'wens: 61c038651aabdcf94bd0ac7ff06c7248db18c600' vm-test-run-secrets> machine # [ 9.744001] faux_driver regulatory: Direct firmware load for regulatory.db failed with error -2 vm-test-run-secrets> machine # [ 9.744399] cfg80211: failed to load regulatory.db vm-test-run-secrets> machine: (finished: must succeed: cat /etc/group-secret >&2, in 0.07 seconds) vm-test-run-secrets> machine: must succeed: [ "$(cat /etc/secret-sops-file)" != "$(cat /etc/secret-sops-file-legacy)" ] vm-test-run-secrets> machine # foo[ 9.795592] dbus-broker-launch[522]: Looking up NSS user entry for 'systemd-timesync'... vm-test-run-secrets> machine # [ 9.816409] dbus-broker-launch[522]: NSS returned no entry for 'systemd-timesync' vm-test-run-secrets> machine # [ 9.821036] dbus-broker-launch[522]: Invalid user-name in /nix/store/z886awd69h6syn0c6qil6zm2kfc7lfrj-system-path/share/dbus-1/system.d/org.freedesktop.timesync1.conf +16: user="systemd-timesync" vm-test-run-secrets> machine: (finished: must succeed: [ "$(cat /etc/secret-sops-file)" != "$(cat /etc/secret-sops-file-legacy)" ], in 0.09 seconds) vm-test-run-secrets> (finished: run the VM test script, in 10.51 seconds) vm-test-run-secrets> machine # [ 9.839291] systemd-logind[539]: Watching system buttons on /dev/input/event0 (gpio-keys) vm-test-run-secrets> machine # [ 9.849166] systemd-logind[539]: New seat seat0. vm-test-run-secrets> machine # [ 9.854426] systemd-networkd[504]: lo: Link UP vm-test-run-secrets> machine # [ 9.859983] systemd-networkd[504]: lo: Gained carrier vm-test-run-secrets> machine # [ 9.865274] systemd[1]: Started Network Management. vm-test-run-secrets> machine # [ 9.865760] systemd[1]: Reached target Network. vm-test-run-secrets> machine # [ 9.866180] systemd[1]: Starting Enable Persistent Storage in systemd-networkd... vm-test-run-secrets> machine # [ 9.872521] systemd[1]: Starting Permit User Sessions... vm-test-run-secrets> machine # [ 9.878356] systemd-networkd[504]: eth1: Found matching .network file, based on potentially unpredictable interface name: /etc/systemd/network/40-eth1.network vm-test-run-secrets> machine # [ 9.879673] systemd-networkd[504]: eth1: Configuring with /etc/systemd/network/40-eth1.network. vm-test-run-secrets> machine # [ 9.892720] systemd[1]: Started D-Bus System Message Bus. vm-test-run-secrets> machine # [ 9.893251] systemd-networkd[504]: eth1: Link UP vm-test-run-secrets> machine # [ 9.893656] systemd-networkd[504]: eth1: Gained carrier vm-test-run-secrets> machine # [ 9.894117] systemd-networkd[504]: eth1: Found matching .network file, based on potentially unpredictable interface name: /etc/systemd/network/40-eth1.network vm-test-run-secrets> machine # [ 9.907160] systemd-networkd[504]: eth0: Configuring with /etc/systemd/network/99-ethernet-default-dhcp.network. vm-test-run-secrets> machine # [ 9.918200] systemd-networkd[504]: eth0: Link UP vm-test-run-secrets> machine # [ 9.918732] systemd-networkd[504]: eth0: Gained carrier vm-test-run-secrets> machine # [ 9.938711] systemd-networkd[504]: eth0: DHCPv4 address 10.0.2.15/24, gateway 10.0.2.2 acquired from 10.0.2.2 vm-test-run-secrets> machine # [ 9.944409] dbus-broker-launch[522]: Ready vm-test-run-secrets> machine # [ 9.950743] systemd[1]: Started User Login Management. vm-test-run-secrets> machine # [ 9.963126] systemd[1]: Starting linger-users.service... vm-test-run-secrets> test script finished in 10.64s vm-test-run-secrets> cleanup vm-test-run-secrets> kill QemuMachine (pid 12) vm-test-run-secrets> machine # qemu-system-aarch64: terminating on signal 15 from pid 6 (/nix/store/akbq19lqha5w5h9hcchn309znqm94pq0-python3-3.13.15/bin/python3.13) vm-test-run-secrets> (finished: cleanup, in 0.12 seconds) upload niks3: failed time=2026-09-10T00:34:58.594Z level=WARN msg="Request returned retryable status, retrying" attempt=1 max_attempts=6 backoff=100ms status=502 url=https://niks3.clan.lol/api/pending_closures time=2026-09-10T00:36:03.546Z level=WARN msg="Request returned retryable status, retrying" attempt=2 max_attempts=6 backoff=187.155328ms status=502 url=https://niks3.clan.lol/api/pending_closures time=2026-09-10T00:41:38.531Z level=WARN msg="Request returned retryable status, retrying" attempt=1 max_attempts=6 backoff=100ms status=504 url=https://niks3.clan.lol/api/pending_closures time=2026-09-10T00:46:38.632Z level=WARN msg="Request returned retryable status, retrying" attempt=2 max_attempts=6 backoff=182.285456ms status=504 url=https://niks3.clan.lol/api/pending_closures time=2026-09-10T00:52:05.427Z level=WARN msg="Request returned retryable status, retrying" attempt=1 max_attempts=6 backoff=100ms status=504 url=https://niks3.clan.lol/api/pending_closures time=2026-09-10T00:57:05.530Z level=WARN msg="Request returned retryable status, retrying" attempt=2 max_attempts=6 backoff=216.110839ms status=504 url=https://niks3.clan.lol/api/pending_closures time=2026-09-10T01:02:05.748Z level=WARN msg="Request returned retryable status, retrying" attempt=3 max_attempts=6 backoff=374.38175ms status=504 url=https://niks3.clan.lol/api/pending_closures time=2026-09-10T01:07:06.123Z level=WARN msg="Request returned retryable status, retrying" attempt=4 max_attempts=6 backoff=789.765369ms status=504 url=https://niks3.clan.lol/api/pending_closures time=2026-09-10T01:12:06.915Z level=WARN msg="Request returned retryable status, retrying" attempt=5 max_attempts=6 backoff=1.610297597s status=504 url=https://niks3.clan.lol/api/pending_closures time=2026-09-10T01:17:08.527Z level=ERROR msg="Fatal error" error="pushing paths: creating pending closures: creating pending closure: server returned 504: "