don't know how to build these paths:
  /nix/store/xy085k00aby0iphf29m48avssq5z747y-container-test-run-data-mesher.drv
warning: ignoring the client-specified setting 'store', because it is a restricted setting and you are not a trusted user
building '/nix/store/i6rv7i2gs7q2l5mip4xj2nqj05ds4v6b-test-script.drv' on nix-store.geninf.io:50051
test-script> build01: building i6rv7i2gs7q2l5mip4xj2nqj05ds4v6b-test-script.drv
test-script> structuredAttrs is enabled
building '/nix/store/8sxrfyr8l3j3n1327cbhdf85axfaghw1-dm.toml.drv' on nix-store.geninf.io:50051
dm.toml> build01: building 8sxrfyr8l3j3n1327cbhdf85axfaghw1-dm.toml.drv
dm.toml> structuredAttrs is enabled
building '/nix/store/c9w7j6511bdfviy7cn491k05a4hy4lgj-dm.toml.drv' on nix-store.geninf.io:50051
dm.toml> build01: building c9w7j6511bdfviy7cn491k05a4hy4lgj-dm.toml.drv
building '/nix/store/95f9yba75p6a8kvlpym89y7a37g8sa1c-dm.toml.drv' on nix-store.geninf.io:50051
dm.toml> build01: building 95f9yba75p6a8kvlpym89y7a37g8sa1c-dm.toml.drv
dm.toml> structuredAttrs is enabled
dm.toml> structuredAttrs is enabled
building '/nix/store/8y5q3ah4h809f06sbcfvxg8pcr0g8aff-decrypt-age-secrets.drv' on nix-store.geninf.io:50051
decrypt-age-secrets> build01: building 8y5q3ah4h809f06sbcfvxg8pcr0g8aff-decrypt-age-secrets.drv
decrypt-age-secrets> structuredAttrs is enabled
building '/nix/store/pvmyv7s65nps0kliag14zq6pxdw268hs-decrypt-age-secrets.drv' on nix-store.geninf.io:50051
decrypt-age-secrets> build01: building pvmyv7s65nps0kliag14zq6pxdw268hs-decrypt-age-secrets.drv
decrypt-age-secrets> structuredAttrs is enabled
building '/nix/store/6q35ycsi9prcvs1ih460sakcqr2fswvv-decrypt-age-secrets.drv' on nix-store.geninf.io:50051
decrypt-age-secrets> build01: building 6q35ycsi9prcvs1ih460sakcqr2fswvv-decrypt-age-secrets.drv
decrypt-age-secrets> structuredAttrs is enabled
building '/nix/store/pp9xbbcrb62zja1b93p16jmdn9k4d81k-X-Restart-Triggers-data-mesher.drv' on nix-store.geninf.io:50051
X-Restart-Triggers-data-mesher> build01: building pp9xbbcrb62zja1b93p16jmdn9k4d81k-X-Restart-Triggers-data-mesher.drv
X-Restart-Triggers-data-mesher> structuredAttrs is enabled
building '/nix/store/69m70mcmzwc26hf50pqimh03kjp7igzp-X-Restart-Triggers-data-mesher.drv' on nix-store.geninf.io:50051
X-Restart-Triggers-data-mesher> build01: building 69m70mcmzwc26hf50pqimh03kjp7igzp-X-Restart-Triggers-data-mesher.drv
X-Restart-Triggers-data-mesher> structuredAttrs is enabled
building '/nix/store/072697g49xais45hgnppp7rkp147gnw8-X-Restart-Triggers-data-mesher.drv' on nix-store.geninf.io:50051
X-Restart-Triggers-data-mesher> build01: building 072697g49xais45hgnppp7rkp147gnw8-X-Restart-Triggers-data-mesher.drv
X-Restart-Triggers-data-mesher> structuredAttrs is enabled
building '/nix/store/qka1jdjhxsg0897ybmrk7cr4wfl8c741-dry-activate.drv' on nix-store.geninf.io:50051
dry-activate> build01: building qka1jdjhxsg0897ybmrk7cr4wfl8c741-dry-activate.drv
dry-activate> structuredAttrs is enabled
building '/nix/store/68d1hdcx7w1n0mwwp7rk7bqwy560p9sf-dry-activate.drv' on nix-store.geninf.io:50051
dry-activate> build01: building 68d1hdcx7w1n0mwwp7rk7bqwy560p9sf-dry-activate.drv
building '/nix/store/mb0fy32aw85i6iv4l731v4gzyfwvl0zc-dry-activate.drv' on nix-store.geninf.io:50051
dry-activate> build01: building mb0fy32aw85i6iv4l731v4gzyfwvl0zc-dry-activate.drv
dry-activate> structuredAttrs is enabled
dry-activate> structuredAttrs is enabled
building '/nix/store/742cyc2psq8z7yxjml2mg018ml4p5mqc-unit-data-mesher.service.drv' on nix-store.geninf.io:50051
unit-data-mesher.service> build01: building 742cyc2psq8z7yxjml2mg018ml4p5mqc-unit-data-mesher.service.drv
unit-data-mesher.service> structuredAttrs is enabled
building '/nix/store/8s3hrgdymfwykl0z96mxrh1dyr28cipa-unit-data-mesher.service.drv' on nix-store.geninf.io:50051
unit-data-mesher.service> build01: building 8s3hrgdymfwykl0z96mxrh1dyr28cipa-unit-data-mesher.service.drv
unit-data-mesher.service> structuredAttrs is enabled
building '/nix/store/j4kdmf6yba05d6r1plbdal6mx6vj359r-unit-data-mesher.service.drv' on nix-store.geninf.io:50051
unit-data-mesher.service> build01: building j4kdmf6yba05d6r1plbdal6mx6vj359r-unit-data-mesher.service.drv
unit-data-mesher.service> structuredAttrs is enabled
building '/nix/store/pz0ifv6d664ppwb1az30plgwl94jq01v-system-units.drv' on nix-store.geninf.io:50051
system-units> build01: building pz0ifv6d664ppwb1az30plgwl94jq01v-system-units.drv
building '/nix/store/lwpybly01c84gp2qx8mwfswsdm4mb3cf-system-units.drv' on nix-store.geninf.io:50051
system-units> build01: building lwpybly01c84gp2qx8mwfswsdm4mb3cf-system-units.drv
building '/nix/store/gl9majh4qirzbwbirzj4fj6lr09imvk8-system-units.drv' on nix-store.geninf.io:50051
system-units> build01: building gl9majh4qirzbwbirzj4fj6lr09imvk8-system-units.drv
building '/nix/store/69x6f3jj9smba3i98z9fa66gh7z1602k-etc.drv' on nix-store.geninf.io:50051
etc> build01: building 69x6f3jj9smba3i98z9fa66gh7z1602k-etc.drv
building '/nix/store/gpcj95gvb2d6c08xfs99fqdn2nhi4c8h-etc.drv' on nix-store.geninf.io:50051
etc> build01: building gpcj95gvb2d6c08xfs99fqdn2nhi4c8h-etc.drv
building '/nix/store/k66iq5jaspcf894qx6la9p55hswyyg7d-etc.drv' on nix-store.geninf.io:50051
etc> build01: building k66iq5jaspcf894qx6la9p55hswyyg7d-etc.drv
building '/nix/store/7q40jqq2fvsj6m3kk0jr6wibbd3z8h14-activate.drv' on nix-store.geninf.io:50051
activate> build01: building 7q40jqq2fvsj6m3kk0jr6wibbd3z8h14-activate.drv
activate> structuredAttrs is enabled
building '/nix/store/9x5yipjjv6yb75hfpnkhdjbslv7q68m2-activate.drv' on nix-store.geninf.io:50051
activate> build01: building 9x5yipjjv6yb75hfpnkhdjbslv7q68m2-activate.drv
activate> structuredAttrs is enabled
building '/nix/store/xif7v6d0hzbzivs3krxn2w5rlx9grjgn-activate.drv' on nix-store.geninf.io:50051
activate> build01: building xif7v6d0hzbzivs3krxn2w5rlx9grjgn-activate.drv
activate> structuredAttrs is enabled
building '/nix/store/yk9b9w2fkr6dm0yp0gpdzckx0ncvhnr8-nixos-system-alpha-test.drv' on nix-store.geninf.io:50051
nixos-system-alpha-test> build01: building yk9b9w2fkr6dm0yp0gpdzckx0ncvhnr8-nixos-system-alpha-test.drv
nixos-system-alpha-test> structuredAttrs is enabled
building '/nix/store/ca6vcxqms3pnnycrhbis1ya61ab1x8qr-nixos-system-beta-test.drv' on nix-store.geninf.io:50051
nixos-system-beta-test> build01: building ca6vcxqms3pnnycrhbis1ya61ab1x8qr-nixos-system-beta-test.drv
nixos-system-beta-test> structuredAttrs is enabled
building '/nix/store/qal7886f8a20zsr5f93sf4xbwglhmn5n-nixos-system-gamma-test.drv' on nix-store.geninf.io:50051
nixos-system-gamma-test> build01: building qal7886f8a20zsr5f93sf4xbwglhmn5n-nixos-system-gamma-test.drv
nixos-system-gamma-test> structuredAttrs is enabled
building '/nix/store/8n6pndl8cmqi93xjhjfvgwy11qqml18w-run-alpha-nspawn.drv' on nix-store.geninf.io:50051
run-alpha-nspawn> build01: building 8n6pndl8cmqi93xjhjfvgwy11qqml18w-run-alpha-nspawn.drv
building '/nix/store/98sj0dkjx06jb6ilw221bl8adijr719r-run-beta-nspawn.drv' on nix-store.geninf.io:50051
run-beta-nspawn> build01: building 98sj0dkjx06jb6ilw221bl8adijr719r-run-beta-nspawn.drv
building '/nix/store/dimhp76qbp0xfzknjgn48sg549si3kbp-run-gamma-nspawn.drv' on nix-store.geninf.io:50051
run-gamma-nspawn> build01: building dimhp76qbp0xfzknjgn48sg549si3kbp-run-gamma-nspawn.drv
building '/nix/store/w78kwsvprvbyf30brfw3qmwin5kcxxhz-driverConfiguration.json.drv' on nix-store.geninf.io:50051
driverConfiguration.json> build01: building w78kwsvprvbyf30brfw3qmwin5kcxxhz-driverConfiguration.json.drv
driverConfiguration.json> structuredAttrs is enabled
building '/nix/store/pq0205hhk34jxhf3yma7n29nr63ilsa9-nixos-test-driver-data-mesher.drv' on nix-store.geninf.io:50051
nixos-test-driver-data-mesher> build01: building pq0205hhk34jxhf3yma7n29nr63ilsa9-nixos-test-driver-data-mesher.drv
nixos-test-driver-data-mesher> Running type check (enable/disable: config.skipTypeCheck)
nixos-test-driver-data-mesher> See https://nixos.org/manual/nixos/stable/#test-opt-skipTypeCheck
nixos-test-driver-data-mesher> All checks passed!
nixos-test-driver-data-mesher> Linting test script (enable/disable: config.skipLint)
nixos-test-driver-data-mesher> See https://nixos.org/manual/nixos/stable/#test-opt-skipLint
nixos-test-driver-data-mesher> All checks passed!
building '/nix/store/xy085k00aby0iphf29m48avssq5z747y-container-test-run-data-mesher.drv' on nix-store.geninf.io:50051
container-test-run-data-mesher> build01: building xy085k00aby0iphf29m48avssq5z747y-container-test-run-data-mesher.drv
container-test-run-data-mesher> Machine state will be reset. To keep it, pass --keep-machine-state
container-test-run-data-mesher> start all VLans
container-test-run-data-mesher> (finished: start all VLans, in 0.00 seconds)
container-test-run-data-mesher> 
container-test-run-data-mesher> Test will time out and terminate in 3600.0 seconds
container-test-run-data-mesher> run the VM test script
container-test-run-data-mesher> additionally exposed symbols:
container-test-run-data-mesher>     alpha, beta, gamma,
container-test-run-data-mesher>     vlan1,
container-test-run-data-mesher>     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
container-test-run-data-mesher> start all VMs
container-test-run-data-mesher> alpha: systemd-nspawn running (pid 52)
container-test-run-data-mesher> beta: systemd-nspawn running (pid 54)
container-test-run-data-mesher> gamma: systemd-nspawn running (pid 56)
container-test-run-data-mesher> alpha: Waiting for journal at /build/vm-state-alpha/var/log/journal...
container-test-run-data-mesher> beta: Waiting for journal at /build/vm-state-beta/var/log/journal...
container-test-run-data-mesher> gamma: Waiting for journal at /build/vm-state-gamma/var/log/journal...
container-test-run-data-mesher> (finished: start all VMs, in 0.00 seconds)
container-test-run-data-mesher> alpha: waiting for unit data-mesher.service
container-test-run-data-mesher> nixos-nspawn(beta): TAP vde-tap1 not found; container will be isolated from VDE
container-test-run-data-mesher> nixos-nspawn(beta): A common reason for this is that /dev/net is not available in the Nix sandbox. Try adding /dev/net to extra-sandbox-paths.
container-test-run-data-mesher> nixos-nspawn(gamma): TAP vde-tap1 not found; container will be isolated from VDE
container-test-run-data-mesher> nixos-nspawn(gamma): A common reason for this is that /dev/net is not available in the Nix sandbox. Try adding /dev/net to extra-sandbox-paths.
container-test-run-data-mesher> nixos-nspawn(alpha): TAP vde-tap1 not found; container will be isolated from VDE
container-test-run-data-mesher> nixos-nspawn(alpha): A common reason for this is that /dev/net is not available in the Nix sandbox. Try adding /dev/net to extra-sandbox-paths.
container-test-run-data-mesher> Note: in a future version of systemd-nspawn the default set of permitted socket address families will be restricted to AF_INET, AF_INET6 and AF_UNIX. Use --restrict-address-families= to configure the set of permitted socket address families, or set RestrictAddressFamilies= in a .nspawn file.
container-test-run-data-mesher> Note: in a future version of systemd-nspawn the default set of permitted socket address families will be restricted to AF_INET, AF_INET6 and AF_UNIX. Use --restrict-address-families= to configure the set of permitted socket address families, or set RestrictAddressFamilies= in a .nspawn file.
container-test-run-data-mesher> Note: in a future version of systemd-nspawn the default set of permitted socket address families will be restricted to AF_INET, AF_INET6 and AF_UNIX. Use --restrict-address-families= to configure the set of permitted socket address families, or set RestrictAddressFamilies= in a .nspawn file.
container-test-run-data-mesher> ░ Spawning container beta on /build/vm-state-beta.
container-test-run-data-mesher> ░ Spawning container alpha on /build/vm-state-alpha.
container-test-run-data-mesher> ░ Spawning container gamma on /build/vm-state-gamma.
container-test-run-data-mesher> beta # No journal files were found.
container-test-run-data-mesher> beta # No journal boot entry found for the specified boot (+0).
container-test-run-data-mesher> alpha # No journal files were found.
container-test-run-data-mesher> alpha # No journal boot entry found for the specified boot (+0).
container-test-run-data-mesher> gamma # No journal files were found.
container-test-run-data-mesher> gamma # No journal boot entry found for the specified boot (+0).
container-test-run-data-mesher> beta # [2897243.450909] beta systemd-journald[90]: Journal started
container-test-run-data-mesher> beta # [2897243.450970] beta systemd-journald[90]: Runtime Journal (/run/log/journal/156f5ce40251403584c31488aa820024) is 8M, max 2.5G, 2.4G free.
container-test-run-data-mesher> beta # [2897243.453652] beta systemd[1]: Finished Apply Kernel Variables.
container-test-run-data-mesher> beta # [2897243.468171] beta systemd[1]: Finished Create Static Device Nodes in /dev gracefully.
container-test-run-data-mesher> beta # [2897243.480884] beta systemd[1]: Starting Flush Journal to Persistent Storage...
container-test-run-data-mesher> beta # [2897243.481659] beta systemd[1]: Starting Network Name Resolution...
container-test-run-data-mesher> beta # [2897243.482334] beta systemd[1]: Starting Create Static Device Nodes in /dev...
container-test-run-data-mesher> beta # [2897243.490207] beta systemd-journald[90]: Time spent on flushing to /var/log/journal/156f5ce40251403584c31488aa820024 is 1.773ms for 7 entries.
container-test-run-data-mesher> beta # [2897243.490207] beta systemd-journald[90]: System Journal (/var/log/journal/156f5ce40251403584c31488aa820024) is 8M, max 4G, 3.9G free.
container-test-run-data-mesher> alpha # [2897243.461106] alpha systemd-journald[90]: Journal started
container-test-run-data-mesher> beta # [2897243.517398] beta systemd[1]: Finished Flush Journal to Persistent Storage.
container-test-run-data-mesher> gamma # [2897243.450656] gamma systemd-journald[89]: Journal started
container-test-run-data-mesher> beta # [2897243.517767] beta systemd[1]: Finished Create Static Device Nodes in /dev.
container-test-run-data-mesher> gamma # [2897243.450722] gamma systemd-journald[89]: Runtime Journal (/run/log/journal/ddaa37f695c84298a5eb03f76222cd21) is 8M, max 2.5G, 2.4G free.
container-test-run-data-mesher> alpha # [2897243.461170] alpha systemd-journald[90]: Runtime Journal (/run/log/journal/5f1614eaaf834d37b931272a4d5211bc) is 8M, max 2.5G, 2.4G free.
container-test-run-data-mesher> gamma # [2897243.459103] gamma systemd[1]: Finished Apply Kernel Variables.
container-test-run-data-mesher> alpha # [2897243.463436] alpha systemd[1]: Finished Apply Kernel Variables.
container-test-run-data-mesher> beta # [2897243.518869] beta systemd[1]: Reached target Preparation for Local File Systems.
container-test-run-data-mesher> alpha # [2897243.474621] alpha systemd[1]: Finished Create Static Device Nodes in /dev gracefully.
container-test-run-data-mesher> gamma # [2897243.471544] gamma systemd[1]: Finished Create Static Device Nodes in /dev gracefully.
container-test-run-data-mesher> alpha # [2897243.487191] alpha systemd[1]: Starting Flush Journal to Persistent Storage...
container-test-run-data-mesher> beta # [2897243.519084] beta systemd[1]: Reached target Local File Systems.
container-test-run-data-mesher> alpha # [2897243.487928] alpha systemd[1]: Starting Network Name Resolution...
container-test-run-data-mesher> beta # [2897243.520042] beta systemd[1]: Listening on Boot Loader Control Service Socket.
container-test-run-data-mesher> alpha # [2897243.488504] alpha systemd[1]: Starting Create Static Device Nodes in /dev...
container-test-run-data-mesher> beta # [2897243.520100] beta systemd[1]: Update Boot Loader Random Seed skipped, unmet condition check ConditionVirtualization=!container
container-test-run-data-mesher> alpha # [2897243.498207] alpha systemd-journald[90]: Time spent on flushing to /var/log/journal/5f1614eaaf834d37b931272a4d5211bc is 1.454ms for 7 entries.
container-test-run-data-mesher> beta # [2897243.520934] beta systemd[1]: Starting Save Transient machine-id to Disk...
container-test-run-data-mesher> alpha # [2897243.498207] alpha systemd-journald[90]: System Journal (/var/log/journal/5f1614eaaf834d37b931272a4d5211bc) is 8M, max 4G, 3.9G free.
container-test-run-data-mesher> beta # [2897243.521663] beta systemd[1]: Starting Create System Files and Directories...
container-test-run-data-mesher> alpha # [2897243.521923] alpha systemd[1]: Finished Flush Journal to Persistent Storage.
container-test-run-data-mesher> beta # [2897243.521697] beta systemd[1]: Rule-based Manager for Device Events and Files skipped, unmet condition check ConditionPathIsReadWrite=/sys
container-test-run-data-mesher> alpha # [2897243.522324] alpha systemd[1]: Finished Create Static Device Nodes in /dev.
container-test-run-data-mesher> beta # [2897243.539862] beta systemd-tmpfiles[150]: Cannot set file attributes for '/var/empty', value=0x00000010, mask=0x00000010, ignoring: Operation not permitted
container-test-run-data-mesher> alpha # [2897243.523300] alpha systemd[1]: Reached target Preparation for Local File Systems.
container-test-run-data-mesher> beta # [2897243.540119] beta systemd-tmpfiles[150]: fchmod() of /var/log/journal failed: Operation not permitted
container-test-run-data-mesher> beta # [2897243.540290] beta systemd-tmpfiles[150]: fchmod() of /var/log/journal/156f5ce40251403584c31488aa820024 failed: Operation not permitted
container-test-run-data-mesher> gamma # [2897243.485097] gamma systemd[1]: Starting Flush Journal to Persistent Storage...
container-test-run-data-mesher> beta # [2897243.540534] beta systemd-tmpfiles[150]: fchmod() of /run/log/journal failed: Operation not permitted
container-test-run-data-mesher> alpha # [2897243.523427] alpha systemd[1]: Reached target Local File Systems.
container-test-run-data-mesher> beta # [2897243.541923] beta systemd[1]: Finished Create System Files and Directories.
container-test-run-data-mesher> alpha # [2897243.524277] alpha systemd[1]: Listening on Boot Loader Control Service Socket.
container-test-run-data-mesher> gamma # [2897243.485886] gamma systemd[1]: Starting Network Name Resolution...
container-test-run-data-mesher> alpha # [2897243.524327] alpha systemd[1]: Update Boot Loader Random Seed skipped, unmet condition check ConditionVirtualization=!container
container-test-run-data-mesher> beta # [2897243.543092] beta systemd[1]: Starting Rebuild Journal Catalog...
container-test-run-data-mesher> alpha # [2897243.525086] alpha systemd[1]: Starting Save Transient machine-id to Disk...
container-test-run-data-mesher> beta # [2897243.544051] beta systemd[1]: Starting Record System Boot/Shutdown in UTMP...
container-test-run-data-mesher> alpha # [2897243.525748] alpha systemd[1]: Starting Create System Files and Directories...
container-test-run-data-mesher> gamma # [2897243.486594] gamma systemd[1]: Starting Create Static Device Nodes in /dev...
container-test-run-data-mesher> alpha # [2897243.525784] alpha systemd[1]: Rule-based Manager for Device Events and Files skipped, unmet condition check ConditionPathIsReadWrite=/sys
container-test-run-data-mesher> gamma # [2897243.495246] gamma systemd-journald[89]: Time spent on flushing to /var/log/journal/ddaa37f695c84298a5eb03f76222cd21 is 2.879ms for 7 entries.
container-test-run-data-mesher> alpha # [2897243.542935] alpha systemd-tmpfiles[149]: Cannot set file attributes for '/var/empty', value=0x00000010, mask=0x00000010, ignoring: Operation not permitted
container-test-run-data-mesher> gamma # [2897243.495246] gamma systemd-journald[89]: System Journal (/var/log/journal/ddaa37f695c84298a5eb03f76222cd21) is 8M, max 4G, 3.9G free.
container-test-run-data-mesher> alpha # [2897243.543145] alpha systemd-tmpfiles[149]: fchmod() of /var/log/journal failed: Operation not permitted
container-test-run-data-mesher> gamma # [2897243.521055] gamma systemd[1]: Finished Flush Journal to Persistent Storage.
container-test-run-data-mesher> alpha # [2897243.543292] alpha systemd-tmpfiles[149]: fchmod() of /var/log/journal/5f1614eaaf834d37b931272a4d5211bc failed: Operation not permitted
container-test-run-data-mesher> gamma # [2897243.521516] gamma systemd[1]: Finished Create Static Device Nodes in /dev.
container-test-run-data-mesher> alpha # [2897243.543510] alpha systemd-tmpfiles[149]: fchmod() of /run/log/journal failed: Operation not permitted
container-test-run-data-mesher> gamma # [2897243.522642] gamma systemd[1]: Reached target Preparation for Local File Systems.
container-test-run-data-mesher> alpha # [2897243.545030] alpha systemd[1]: Finished Create System Files and Directories.
container-test-run-data-mesher> beta # [2897243.558336] beta systemd[1]: Finished Record System Boot/Shutdown in UTMP.
container-test-run-data-mesher> gamma # [2897243.522747] gamma systemd[1]: Reached target Local File Systems.
container-test-run-data-mesher> beta # [2897243.564344] beta systemd[1]: Finished Rebuild Journal Catalog.
container-test-run-data-mesher> alpha # [2897243.546207] alpha systemd[1]: Starting Rebuild Journal Catalog...
container-test-run-data-mesher> gamma # [2897243.523589] gamma systemd[1]: Listening on Boot Loader Control Service Socket.
container-test-run-data-mesher> alpha # [2897243.546893] alpha systemd[1]: Starting Record System Boot/Shutdown in UTMP...
container-test-run-data-mesher> beta # [2897243.565369] beta systemd[1]: Starting Update is Completed...
container-test-run-data-mesher> alpha # [2897243.560299] alpha systemd[1]: Finished Record System Boot/Shutdown in UTMP.
container-test-run-data-mesher> beta # [2897243.575807] beta systemd[1]: Finished Update is Completed.
container-test-run-data-mesher> alpha # [2897243.569954] alpha systemd[1]: Finished Rebuild Journal Catalog.
container-test-run-data-mesher> beta # [2897243.614489] beta systemd[1]: Finished Firewall.
container-test-run-data-mesher> gamma # [2897243.523642] gamma systemd[1]: Update Boot Loader Random Seed skipped, unmet condition check ConditionVirtualization=!container
container-test-run-data-mesher> beta # [2897243.614638] beta systemd[1]: Reached target Preparation for Network.
container-test-run-data-mesher> gamma # [2897243.524601] gamma systemd[1]: Starting Save Transient machine-id to Disk...
container-test-run-data-mesher> beta # [2897243.614856] beta systemd[1]: Listening on Network Management Resolve Hook Socket.
container-test-run-data-mesher> gamma # [2897243.525310] gamma systemd[1]: Starting Create System Files and Directories...
container-test-run-data-mesher> beta # [2897243.615943] beta systemd[1]: Starting Network Management...
container-test-run-data-mesher> gamma # [2897243.525345] gamma systemd[1]: Rule-based Manager for Device Events and Files skipped, unmet condition check ConditionPathIsReadWrite=/sys
container-test-run-data-mesher> alpha # [2897243.571153] alpha systemd[1]: Starting Update is Completed...
container-test-run-data-mesher> gamma # [2897243.543455] gamma systemd-tmpfiles[152]: Cannot set file attributes for '/var/empty', value=0x00000010, mask=0x00000010, ignoring: Operation not permitted
container-test-run-data-mesher> alpha # [2897243.581084] alpha systemd[1]: Finished Update is Completed.
container-test-run-data-mesher> gamma # [2897243.543657] gamma systemd-tmpfiles[152]: fchmod() of /var/log/journal failed: Operation not permitted
container-test-run-data-mesher> alpha # [2897243.660231] alpha systemd[1]: Finished Firewall.
container-test-run-data-mesher> beta # [2897243.701129] beta systemd[1]: Finished Save Transient machine-id to Disk.
container-test-run-data-mesher> alpha # [2897243.660415] alpha systemd[1]: Reached target Preparation for Network.
container-test-run-data-mesher> beta # [2897244.326826] beta systemd-networkd[207]: Failed to increase receive buffer size for general netlink socket, ignoring: Operation not permitted
container-test-run-data-mesher> alpha # [2897243.660642] alpha systemd[1]: Listening on Network Management Resolve Hook Socket.
container-test-run-data-mesher> beta # [2897244.326915] beta systemd-networkd[207]: Failed to increase receive buffer size for nftables netlink socket, ignoring: Operation not permitted
container-test-run-data-mesher> alpha # [2897243.661629] alpha systemd[1]: Starting Network Management...
container-test-run-data-mesher> beta # [2897244.336292] beta systemd-networkd[207]: /etc/systemd/network/99-ethernet-default-dhcp.network: No valid settings found in the [Match] section, ignoring file. To match all interfaces, add Name=* in the [Match] section.
container-test-run-data-mesher> alpha # [2897243.701130] alpha systemd[1]: Finished Save Transient machine-id to Disk.
container-test-run-data-mesher> beta # [2897244.336460] beta systemd-networkd[207]: /etc/systemd/network/99-wireless-client-dhcp.network: No valid settings found in the [Match] section, ignoring file. To match all interfaces, add Name=* in the [Match] section.
container-test-run-data-mesher> alpha # [2897244.290602] alpha systemd-networkd[207]: Failed to increase receive buffer size for general netlink socket, ignoring: Operation not permitted
container-test-run-data-mesher> beta # [2897244.336611] beta systemd-networkd[207]: lo: Link UP
container-test-run-data-mesher> alpha # [2897244.290699] alpha systemd-networkd[207]: Failed to increase receive buffer size for nftables netlink socket, ignoring: Operation not permitted
container-test-run-data-mesher> gamma # [2897243.543804] gamma systemd-tmpfiles[152]: fchmod() of /var/log/journal/ddaa37f695c84298a5eb03f76222cd21 failed: Operation not permitted
container-test-run-data-mesher> alpha # [2897244.299968] alpha systemd-networkd[207]: /etc/systemd/network/99-ethernet-default-dhcp.network: No valid settings found in the [Match] section, ignoring file. To match all interfaces, add Name=* in the [Match] section.
container-test-run-data-mesher> gamma # [2897243.544062] gamma systemd-tmpfiles[152]: fchmod() of /run/log/journal failed: Operation not permitted
container-test-run-data-mesher> alpha # [2897244.300759] alpha systemd-networkd[207]: /etc/systemd/network/99-wireless-client-dhcp.network: No valid settings found in the [Match] section, ignoring file. To match all interfaces, add Name=* in the [Match] section.
container-test-run-data-mesher> alpha # [2897244.300919] alpha systemd-networkd[207]: lo: Link UP
container-test-run-data-mesher> alpha # [2897244.300925] alpha systemd-networkd[207]: lo: Gained carrier
container-test-run-data-mesher> alpha # [2897244.301097] alpha systemd-networkd[207]: eth1: Configuring with /etc/systemd/network/40-eth1.network.
container-test-run-data-mesher> alpha # [2897244.301538] alpha systemd[1]: Started Network Management.
container-test-run-data-mesher> alpha # [2897244.301586] alpha systemd-networkd[207]: eth1: Link UP
container-test-run-data-mesher> alpha # [2897244.301911] alpha systemd-networkd[207]: eth1: Gained carrier
container-test-run-data-mesher> alpha # [2897244.303397] alpha systemd[1]: Starting Enable Persistent Storage in systemd-networkd...
container-test-run-data-mesher> alpha # [2897244.350335] alpha systemd[1]: Finished Enable Persistent Storage in systemd-networkd.
container-test-run-data-mesher> gamma # [2897243.545504] gamma systemd[1]: Finished Create System Files and Directories.
container-test-run-data-mesher> gamma # [2897243.546509] gamma systemd[1]: Starting Rebuild Journal Catalog...
container-test-run-data-mesher> gamma # [2897243.547184] gamma systemd[1]: Starting Record System Boot/Shutdown in UTMP...
container-test-run-data-mesher> gamma # [2897243.561913] gamma systemd[1]: Finished Record System Boot/Shutdown in UTMP.
container-test-run-data-mesher> gamma # [2897243.569955] gamma systemd[1]: Finished Rebuild Journal Catalog.
container-test-run-data-mesher> gamma # [2897243.571152] gamma systemd[1]: Starting Update is Completed...
container-test-run-data-mesher> beta # [2897244.336617] beta systemd-networkd[207]: lo: Gained carrier
container-test-run-data-mesher> gamma # [2897243.582505] gamma systemd[1]: Finished Update is Completed.
container-test-run-data-mesher> beta # [2897244.336783] beta systemd-networkd[207]: eth1: Configuring with /etc/systemd/network/40-eth1.network.
container-test-run-data-mesher> gamma # [2897243.616897] gamma systemd[1]: Finished Firewall.
container-test-run-data-mesher> gamma # [2897243.617046] gamma systemd[1]: Reached target Preparation for Network.
container-test-run-data-mesher> gamma # [2897243.617258] gamma systemd[1]: Listening on Network Management Resolve Hook Socket.
container-test-run-data-mesher> gamma # [2897243.618236] gamma systemd[1]: Starting Network Management...
container-test-run-data-mesher> beta # [2897244.337238] beta systemd[1]: Started Network Management.
container-test-run-data-mesher> beta # [2897244.337257] beta systemd-networkd[207]: eth1: Link UP
container-test-run-data-mesher> beta # [2897244.337573] beta systemd-networkd[207]: eth1: Gained carrier
container-test-run-data-mesher> gamma # [2897243.701529] gamma systemd[1]: Finished Save Transient machine-id to Disk.
container-test-run-data-mesher> beta # [2897244.338849] beta systemd[1]: Starting Enable Persistent Storage in systemd-networkd...
container-test-run-data-mesher> gamma # [2897244.303271] gamma systemd-networkd[206]: Failed to increase receive buffer size for general netlink socket, ignoring: Operation not permitted
container-test-run-data-mesher> beta # [2897244.382627] beta systemd[1]: Finished Enable Persistent Storage in systemd-networkd.
container-test-run-data-mesher> gamma # [2897244.303357] gamma systemd-networkd[206]: Failed to increase receive buffer size for nftables netlink socket, ignoring: Operation not permitted
container-test-run-data-mesher> gamma # [2897244.313619] gamma systemd-networkd[206]: /etc/systemd/network/99-ethernet-default-dhcp.network: No valid settings found in the [Match] section, ignoring file. To match all interfaces, add Name=* in the [Match] section.
container-test-run-data-mesher> gamma # [2897244.313781] gamma systemd-networkd[206]: /etc/systemd/network/99-wireless-client-dhcp.network: No valid settings found in the [Match] section, ignoring file. To match all interfaces, add Name=* in the [Match] section.
container-test-run-data-mesher> gamma # [2897244.313934] gamma systemd-networkd[206]: lo: Link UP
container-test-run-data-mesher> gamma # [2897244.313939] gamma systemd-networkd[206]: lo: Gained carrier
container-test-run-data-mesher> gamma # [2897244.314107] gamma systemd-networkd[206]: eth1: Configuring with /etc/systemd/network/40-eth1.network.
container-test-run-data-mesher> gamma # [2897244.314485] gamma systemd[1]: Started Network Management.
container-test-run-data-mesher> gamma # [2897244.332249] gamma systemd-networkd[206]: eth1: Link UP
container-test-run-data-mesher> gamma # [2897244.332572] gamma systemd-networkd[206]: eth1: Gained carrier
container-test-run-data-mesher> gamma # [2897244.333541] gamma systemd[1]: Starting Enable Persistent Storage in systemd-networkd...
container-test-run-data-mesher> gamma # [2897244.362422] gamma systemd[1]: Finished Enable Persistent Storage in systemd-networkd.
container-test-run-data-mesher> alpha # [2897244.468892] alpha systemd[1]: etc-machine\x2did.mount: Deactivated successfully.
container-test-run-data-mesher> gamma # [2897244.459604] gamma systemd[1]: etc-machine\x2did.mount: Deactivated successfully.
container-test-run-data-mesher> beta # [2897244.459144] beta systemd[1]: etc-machine\x2did.mount: Deactivated successfully.
container-test-run-data-mesher> beta # [2897244.611009] beta systemd-resolved[123]: Positive Trust Anchors:
container-test-run-data-mesher> beta # [2897244.611021] beta systemd-resolved[123]: . IN DS 20326 8 2 e06d44b80b8f1d39a95c0b0d7c65d08458e880409bbc683457104237c7f8ec8d
container-test-run-data-mesher> beta # [2897244.611023] beta systemd-resolved[123]: . IN DS 38696 8 2 683d2d0acb8c9b712a1948b27f741219298d0a450d612c483af444a4c0fb2b16
container-test-run-data-mesher> beta # [2897244.611057] beta systemd-resolved[123]: 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
container-test-run-data-mesher> beta # [2897244.631178] beta systemd-resolved[123]: Using system hostname 'beta'.
container-test-run-data-mesher> beta # [2897244.633203] beta systemd[1]: Started Network Name Resolution.
container-test-run-data-mesher> beta # [2897244.633327] beta systemd[1]: Reached target Network.
container-test-run-data-mesher> beta # [2897244.633445] beta systemd[1]: Reached target System Initialization.
container-test-run-data-mesher> beta # [2897244.633535] beta systemd[1]: Discard unused filesystem blocks once a week skipped, unmet condition check ConditionVirtualization=!container
container-test-run-data-mesher> beta # [2897244.633591] beta systemd[1]: Started Daily Cleanup of Temporary Directories.
container-test-run-data-mesher> beta # [2897244.633630] beta systemd[1]: Reached target Timer Units.
container-test-run-data-mesher> beta # [2897244.633848] beta systemd[1]: Listening on D-Bus System Message Bus Socket.
container-test-run-data-mesher> beta # [2897244.634049] beta systemd[1]: Listening on Nix Daemon Socket.
container-test-run-data-mesher> beta # [2897244.634261] beta systemd[1]: Listening on Virtual Machine and Container Registration Service Socket.
container-test-run-data-mesher> beta # [2897244.634307] beta systemd[1]: Reached target Socket Units.
container-test-run-data-mesher> beta # [2897244.634385] beta systemd[1]: Reached target Basic System.
container-test-run-data-mesher> beta # [2897244.664736] beta systemd[1]: Starting data mesher daemon...
container-test-run-data-mesher> beta # [2897244.666178] beta systemd[1]: Starting Import lastlog data into lastlog2 database...
container-test-run-data-mesher> beta # [2897244.667686] beta systemd[1]: Starting Name Service Cache Daemon (nsncd)...
container-test-run-data-mesher> beta # [2897244.669748] beta systemd[1]: Starting D-Bus System Message Bus...
container-test-run-data-mesher> beta # [2897244.688398] beta systemd[1]: Finished Import lastlog data into lastlog2 database.
container-test-run-data-mesher> gamma # [2897244.603905] gamma systemd-resolved[125]: Positive Trust Anchors:
container-test-run-data-mesher> gamma # [2897244.603915] gamma systemd-resolved[125]: . IN DS 20326 8 2 e06d44b80b8f1d39a95c0b0d7c65d08458e880409bbc683457104237c7f8ec8d
container-test-run-data-mesher> gamma # [2897244.603918] gamma systemd-resolved[125]: . IN DS 38696 8 2 683d2d0acb8c9b712a1948b27f741219298d0a450d612c483af444a4c0fb2b16
container-test-run-data-mesher> gamma # [2897244.603953] gamma systemd-resolved[125]: 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
container-test-run-data-mesher> gamma # [2897244.624953] gamma systemd-resolved[125]: Using system hostname 'gamma'.
container-test-run-data-mesher> gamma # [2897244.626320] gamma systemd[1]: Started Network Name Resolution.
container-test-run-data-mesher> gamma # [2897244.626458] gamma systemd[1]: Reached target Network.
container-test-run-data-mesher> gamma # [2897244.626582] gamma systemd[1]: Reached target System Initialization.
container-test-run-data-mesher> gamma # [2897244.626681] gamma systemd[1]: Discard unused filesystem blocks once a week skipped, unmet condition check ConditionVirtualization=!container
container-test-run-data-mesher> gamma # [2897244.626749] gamma systemd[1]: Started Daily Cleanup of Temporary Directories.
container-test-run-data-mesher> gamma # [2897244.626789] gamma systemd[1]: Reached target Timer Units.
container-test-run-data-mesher> gamma # [2897244.627019] gamma systemd[1]: Listening on D-Bus System Message Bus Socket.
container-test-run-data-mesher> gamma # [2897244.627374] gamma systemd[1]: Listening on Nix Daemon Socket.
container-test-run-data-mesher> gamma # [2897244.627614] gamma systemd[1]: Listening on Virtual Machine and Container Registration Service Socket.
container-test-run-data-mesher> gamma # [2897244.627664] gamma systemd[1]: Reached target Socket Units.
container-test-run-data-mesher> gamma # [2897244.627748] gamma systemd[1]: Reached target Basic System.
container-test-run-data-mesher> gamma # [2897244.664497] gamma systemd[1]: Starting data mesher daemon...
container-test-run-data-mesher> gamma # [2897244.665949] gamma systemd[1]: Starting Import lastlog data into lastlog2 database...
container-test-run-data-mesher> gamma # [2897244.667443] gamma systemd[1]: Starting Name Service Cache Daemon (nsncd)...
container-test-run-data-mesher> gamma # [2897244.669546] gamma systemd[1]: Starting D-Bus System Message Bus...
container-test-run-data-mesher> gamma # [2897244.688584] gamma systemd[1]: Finished Import lastlog data into lastlog2 database.
container-test-run-data-mesher> gamma # [2897244.938342] gamma systemd[1]: Started Name Service Cache Daemon (nsncd).
container-test-run-data-mesher> alpha # [2897244.597392] alpha systemd-resolved[123]: Positive Trust Anchors:
container-test-run-data-mesher> alpha # [2897244.597403] alpha systemd-resolved[123]: . IN DS 20326 8 2 e06d44b80b8f1d39a95c0b0d7c65d08458e880409bbc683457104237c7f8ec8d
container-test-run-data-mesher> alpha # [2897244.597407] alpha systemd-resolved[123]: . IN DS 38696 8 2 683d2d0acb8c9b712a1948b27f741219298d0a450d612c483af444a4c0fb2b16
container-test-run-data-mesher> alpha # [2897244.597441] alpha systemd-resolved[123]: 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
container-test-run-data-mesher> alpha # [2897244.618562] alpha systemd-resolved[123]: Using system hostname 'alpha'.
container-test-run-data-mesher> alpha # [2897244.619910] alpha systemd[1]: Started Network Name Resolution.
container-test-run-data-mesher> alpha # [2897244.620066] alpha systemd[1]: Reached target Network.
container-test-run-data-mesher> alpha # [2897244.620186] alpha systemd[1]: Reached target System Initialization.
container-test-run-data-mesher> alpha # [2897244.620282] alpha systemd[1]: Discard unused filesystem blocks once a week skipped, unmet condition check ConditionVirtualization=!container
container-test-run-data-mesher> alpha # [2897244.620334] alpha systemd[1]: Started Daily Cleanup of Temporary Directories.
container-test-run-data-mesher> alpha # [2897244.620372] alpha systemd[1]: Reached target Timer Units.
container-test-run-data-mesher> alpha # [2897244.620600] alpha systemd[1]: Listening on D-Bus System Message Bus Socket.
container-test-run-data-mesher> alpha # [2897244.620815] alpha systemd[1]: Listening on Nix Daemon Socket.
container-test-run-data-mesher> alpha # [2897244.621029] alpha systemd[1]: Listening on Virtual Machine and Container Registration Service Socket.
container-test-run-data-mesher> alpha # [2897244.621079] alpha systemd[1]: Reached target Socket Units.
container-test-run-data-mesher> alpha # [2897244.621153] alpha systemd[1]: Reached target Basic System.
container-test-run-data-mesher> alpha # [2897244.623321] alpha systemd[1]: Starting data mesher daemon...
container-test-run-data-mesher> alpha # [2897244.624614] alpha systemd[1]: Starting Import lastlog data into lastlog2 database...
container-test-run-data-mesher> alpha # [2897244.626044] alpha systemd[1]: Starting Name Service Cache Daemon (nsncd)...
container-test-run-data-mesher> alpha # [2897244.628248] alpha systemd[1]: Starting D-Bus System Message Bus...
container-test-run-data-mesher> alpha # [2897244.683900] alpha systemd[1]: Finished Import lastlog data into lastlog2 database.
container-test-run-data-mesher> alpha # [2897244.972107] alpha systemd[1]: Started Name Service Cache Daemon (nsncd).
container-test-run-data-mesher> alpha # [2897244.972215] alpha systemd[1]: Reached target Host and Network Name Lookups.
container-test-run-data-mesher> alpha # [2897244.972325] alpha systemd[1]: Reached target User and Group Name Lookups.
container-test-run-data-mesher> alpha # [2897244.972558] alpha nsncd[215]: Oct 07 20:14:24.958 INFO started, config: Config { ignored_request_types: {}, worker_count: 8, handoff_timeout: 10s }, path: "/var/run/nscd/socket"
container-test-run-data-mesher> gamma # [2897244.938768] gamma nsncd[214]: Oct 07 20:14:24.924 INFO started, config: Config { ignored_request_types: {}, worker_count: 8, handoff_timeout: 10s }, path: "/var/run/nscd/socket"
container-test-run-data-mesher> gamma # [2897244.938450] gamma systemd[1]: Reached target Host and Network Name Lookups.
container-test-run-data-mesher> gamma # [2897244.938563] gamma systemd[1]: Reached target User and Group Name Lookups.
container-test-run-data-mesher> gamma # [2897244.940700] gamma systemd[1]: Starting User Login Management...
container-test-run-data-mesher> gamma # [2897244.942072] gamma systemd[1]: Starting Permit User Sessions...
container-test-run-data-mesher> gamma # [2897244.994639] gamma systemd[1]: Finished Permit User Sessions.
container-test-run-data-mesher> gamma # [2897244.997022] gamma systemd[1]: Started Console Getty.
container-test-run-data-mesher> gamma # [2897244.997106] gamma systemd[1]: Getty on tty1 skipped, unmet condition check ConditionPathExists=/dev/tty0
container-test-run-data-mesher> gamma # [2897244.997146] gamma systemd[1]: Reached target Login Prompts.
container-test-run-data-mesher> gamma # [2897245.110599] gamma dbus-broker-launch[215]: Looking up NSS user entry for 'systemd-timesync'...
container-test-run-data-mesher> gamma # [2897245.111810] gamma dbus-broker-launch[215]: NSS returned no entry for 'systemd-timesync'
container-test-run-data-mesher> gamma # [2897245.111810] gamma dbus-broker-launch[215]: Invalid user-name in /nix/store/sb5cflcgyhbx0bpfxk1mgw69lir23mdb-system-path/share/dbus-1/system.d/org.freedesktop.timesync1.conf +16: user="systemd-timesync"
container-test-run-data-mesher> gamma # [2897245.112272] gamma systemd[1]: Started D-Bus System Message Bus.
container-test-run-data-mesher> gamma # [2897245.121061] gamma dbus-broker-launch[215]: Ready
container-test-run-data-mesher> alpha # [2897244.988526] alpha systemd[1]: Starting User Login Management...
container-test-run-data-mesher> alpha # [2897244.990038] alpha systemd[1]: Starting Permit User Sessions...
container-test-run-data-mesher> alpha # [2897245.003393] alpha systemd[1]: Finished Permit User Sessions.
container-test-run-data-mesher> alpha # [2897245.005014] alpha systemd[1]: Started Console Getty.
container-test-run-data-mesher> alpha # [2897245.005091] alpha systemd[1]: Getty on tty1 skipped, unmet condition check ConditionPathExists=/dev/tty0
container-test-run-data-mesher> alpha # [2897245.005129] alpha systemd[1]: Reached target Login Prompts.
container-test-run-data-mesher> alpha # [2897245.108537] alpha dbus-broker-launch[216]: Looking up NSS user entry for 'systemd-timesync'...
container-test-run-data-mesher> alpha # [2897245.109621] alpha dbus-broker-launch[216]: NSS returned no entry for 'systemd-timesync'
container-test-run-data-mesher> alpha # [2897245.109621] alpha dbus-broker-launch[216]: Invalid user-name in /nix/store/sb5cflcgyhbx0bpfxk1mgw69lir23mdb-system-path/share/dbus-1/system.d/org.freedesktop.timesync1.conf +16: user="systemd-timesync"
container-test-run-data-mesher> alpha # [2897245.112287] alpha systemd[1]: Started D-Bus System Message Bus.
container-test-run-data-mesher> alpha # [2897245.120800] alpha dbus-broker-launch[216]: Ready
container-test-run-data-mesher> beta # [2897244.940623] beta systemd[1]: Started Name Service Cache Daemon (nsncd).
container-test-run-data-mesher> beta # [2897244.940696] beta systemd[1]: Reached target Host and Network Name Lookups.
container-test-run-data-mesher> beta # [2897244.940773] beta systemd[1]: Reached target User and Group Name Lookups.
container-test-run-data-mesher> beta # [2897244.941079] beta nsncd[215]: Oct 07 20:14:24.926 INFO started, config: Config { ignored_request_types: {}, worker_count: 8, handoff_timeout: 10s }, path: "/var/run/nscd/socket"
container-test-run-data-mesher> beta # [2897244.942294] beta systemd[1]: Starting User Login Management...
container-test-run-data-mesher> beta # [2897244.943310] beta systemd[1]: Starting Permit User Sessions...
container-test-run-data-mesher> beta # [2897244.997248] beta systemd[1]: Finished Permit User Sessions.
container-test-run-data-mesher> beta # [2897244.998375] beta systemd[1]: Started Console Getty.
container-test-run-data-mesher> beta # [2897244.998429] beta systemd[1]: Getty on tty1 skipped, unmet condition check ConditionPathExists=/dev/tty0
container-test-run-data-mesher> beta # [2897244.998456] beta systemd[1]: Reached target Login Prompts.
container-test-run-data-mesher> beta # [2897245.108581] beta dbus-broker-launch[216]: Looking up NSS user entry for 'systemd-timesync'...
container-test-run-data-mesher> beta # [2897245.109668] beta dbus-broker-launch[216]: NSS returned no entry for 'systemd-timesync'
container-test-run-data-mesher> beta # [2897245.109668] beta dbus-broker-launch[216]: Invalid user-name in /nix/store/sb5cflcgyhbx0bpfxk1mgw69lir23mdb-system-path/share/dbus-1/system.d/org.freedesktop.timesync1.conf +16: user="systemd-timesync"
container-test-run-data-mesher> beta # [2897245.112276] beta systemd[1]: Started D-Bus System Message Bus.
container-test-run-data-mesher> beta # [2897245.119129] beta dbus-broker-launch[216]: Ready
container-test-run-data-mesher> beta # [2897245.472287] beta systemd-networkd[207]: eth1: Gained IPv6LL
container-test-run-data-mesher> beta # [2897245.511922] beta data-mesher[213]: time=2026-10-07T20:14:25.497Z level=DEBUG msg="http config" listen_addresses="[[::1]:7331 127.0.0.1:7331]" port=7331 interfaces=[lo]
container-test-run-data-mesher> beta # [2897245.513189] beta data-mesher[213]: time=2026-10-07T20:14:25.498Z level=DEBUG msg="cluster config" port=7946 interfaces=[] bootstrap_peers="[{12D3KooWGd9GzvUzHtYYJiEeQSXw5sUKG3GwJBnRGGmdxGoWqFqD: [/dns/alpha.clan/tcp/7946]} {12D3KooWSSRYsgtDV5jPaiEEwjKfV9iVCy9735tuqT1m2FSuBxqy: [/dns/beta.clan/tcp/7946]}]" push_pull_interval=5s peer_id=12D3KooWSSRYsgtDV5jPaiEEwjKfV9iVCy9735tuqT1m2FSuBxqy
container-test-run-data-mesher> beta # [2897245.513189] beta data-mesher[213]: time=2026-10-07T20:14:25.499Z level=INFO msg="config loaded" config_file=/etc/data-mesher/dm.toml
container-test-run-data-mesher> beta # [2897245.529383] beta data-mesher[213]: time=2026-10-07T20:14:25.515Z level=INFO msg="checking file integrity"
container-test-run-data-mesher> beta # [2897245.529512] beta data-mesher[213]: time=2026-10-07T20:14:25.515Z level=INFO msg="file integrity check complete"
container-test-run-data-mesher> beta # [2897245.533645] beta data-mesher[213]: time=2026-10-07T20:14:25.519Z level=INFO msg="libp2p host created" peer_id=12D3KooWSSRYsgtDV5jPaiEEwjKfV9iVCy9735tuqT1m2FSuBxqy addresses="[/ip4/127.0.0.1/tcp/7946 /ip4/192.168.1.2/tcp/7946 /ip6/::1/tcp/7946 /ip6/2001:db8:1::2/tcp/7946]"
container-test-run-data-mesher> beta # [2897245.533739] beta data-mesher[213]: time=2026-10-07T20:14:25.519Z level=INFO msg="registered HTTP route" method=DELETE path=/files/:name
container-test-run-data-mesher> beta # [2897245.533739] beta data-mesher[213]: time=2026-10-07T20:14:25.519Z level=INFO msg="registered HTTP route" method=GET path=/files
container-test-run-data-mesher> beta # [2897245.533739] beta data-mesher[213]: time=2026-10-07T20:14:25.519Z level=INFO msg="registered HTTP route" method=PUT path=/files/:name
container-test-run-data-mesher> beta # [2897245.533739] beta data-mesher[213]: time=2026-10-07T20:14:25.519Z level=INFO msg="starting server"
container-test-run-data-mesher> beta # [2897245.533858] beta data-mesher[213]: time=2026-10-07T20:14:25.519Z level=INFO msg="waiting for DHT to populate" delay=10s
container-test-run-data-mesher> beta # [2897245.533887] beta data-mesher[213]: time=2026-10-07T20:14:25.519Z level=INFO msg="HTTP server listening" address=[::1]:7331
container-test-run-data-mesher> beta # [2897245.533986] beta data-mesher[213]: time=2026-10-07T20:14:25.519Z level=INFO msg="HTTP server listening" address=127.0.0.1:7331
container-test-run-data-mesher> beta # [2897245.541820] beta data-mesher[213]: time=2026-10-07T20:14:25.527Z level=INFO msg="peer connected" peer_id=12D3KooWGd9GzvUzHtYYJiEeQSXw5sUKG3GwJBnRGGmdxGoWqFqD remote_addr=/ip4/192.168.1.1/tcp/7946
container-test-run-data-mesher> beta # [2897245.542386] beta data-mesher[213]: time=2026-10-07T20:14:25.528Z level=INFO msg="peer connected" peer_id=12D3KooWGd9GzvUzHtYYJiEeQSXw5sUKG3GwJBnRGGmdxGoWqFqD remote_addr=/ip4/192.168.1.1/tcp/38116
container-test-run-data-mesher> beta # [2897245.546784] beta data-mesher[213]: time=2026-10-07T20:14:25.532Z level=INFO msg="peer connected" peer_id=12D3KooWCYLTjRnfE7mkT3YKALPu3LU6CxFNhKtCt1YKtwA9Ldnx remote_addr=/ip4/192.168.1.3/tcp/7946
container-test-run-data-mesher> alpha # [2897245.523024] alpha data-mesher[213]: time=2026-10-07T20:14:25.508Z level=DEBUG msg="http config" listen_addresses="[[::1]:7331 127.0.0.1:7331]" port=7331 interfaces=[lo]
container-test-run-data-mesher> alpha # [2897245.528493] alpha data-mesher[213]: time=2026-10-07T20:14:25.509Z level=DEBUG msg="cluster config" port=7946 interfaces=[] bootstrap_peers="[{12D3KooWGd9GzvUzHtYYJiEeQSXw5sUKG3GwJBnRGGmdxGoWqFqD: [/dns/alpha.clan/tcp/7946]} {12D3KooWSSRYsgtDV5jPaiEEwjKfV9iVCy9735tuqT1m2FSuBxqy: [/dns/beta.clan/tcp/7946]}]" push_pull_interval=5s peer_id=12D3KooWGd9GzvUzHtYYJiEeQSXw5sUKG3GwJBnRGGmdxGoWqFqD
container-test-run-data-mesher> alpha # [2897245.528493] alpha data-mesher[213]: time=2026-10-07T20:14:25.509Z level=INFO msg="config loaded" config_file=/etc/data-mesher/dm.toml
container-test-run-data-mesher> alpha # [2897245.530441] alpha data-mesher[213]: time=2026-10-07T20:14:25.516Z level=INFO msg="checking file integrity"
container-test-run-data-mesher> alpha # [2897245.530549] alpha data-mesher[213]: time=2026-10-07T20:14:25.516Z level=INFO msg="file integrity check complete"
container-test-run-data-mesher> alpha # [2897245.534341] alpha data-mesher[213]: time=2026-10-07T20:14:25.520Z level=INFO msg="libp2p host created" peer_id=12D3KooWGd9GzvUzHtYYJiEeQSXw5sUKG3GwJBnRGGmdxGoWqFqD addresses="[/ip4/127.0.0.1/tcp/7946 /ip4/192.168.1.1/tcp/7946 /ip6/::1/tcp/7946 /ip6/2001:db8:1::1/tcp/7946]"
container-test-run-data-mesher> alpha # [2897245.534381] alpha data-mesher[213]: time=2026-10-07T20:14:25.520Z level=INFO msg="registered HTTP route" method=GET path=/files
container-test-run-data-mesher> alpha # [2897245.534381] alpha data-mesher[213]: time=2026-10-07T20:14:25.520Z level=INFO msg="registered HTTP route" method=PUT path=/files/:name
container-test-run-data-mesher> alpha # [2897245.534381] alpha data-mesher[213]: time=2026-10-07T20:14:25.520Z level=INFO msg="registered HTTP route" method=DELETE path=/files/:name
container-test-run-data-mesher> alpha # [2897245.534381] alpha data-mesher[213]: time=2026-10-07T20:14:25.520Z level=INFO msg="starting server"
container-test-run-data-mesher> alpha # [2897245.534518] alpha data-mesher[213]: time=2026-10-07T20:14:25.520Z level=INFO msg="waiting for DHT to populate" delay=10s
container-test-run-data-mesher> alpha # [2897245.534518] alpha data-mesher[213]: time=2026-10-07T20:14:25.520Z level=INFO msg="HTTP server listening" address=[::1]:7331
container-test-run-data-mesher> alpha # [2897245.534579] alpha data-mesher[213]: time=2026-10-07T20:14:25.520Z level=INFO msg="HTTP server listening" address=127.0.0.1:7331
container-test-run-data-mesher> alpha # [2897245.540845] alpha data-mesher[213]: time=2026-10-07T20:14:25.526Z level=INFO msg="peer connected" peer_id=12D3KooWSSRYsgtDV5jPaiEEwjKfV9iVCy9735tuqT1m2FSuBxqy remote_addr=/ip4/192.168.1.2/tcp/7946
container-test-run-data-mesher> alpha # [2897245.541528] alpha data-mesher[213]: time=2026-10-07T20:14:25.527Z level=INFO msg="peer connected" peer_id=12D3KooWCYLTjRnfE7mkT3YKALPu3LU6CxFNhKtCt1YKtwA9Ldnx remote_addr=/ip4/192.168.1.3/tcp/7946
container-test-run-data-mesher> alpha # [2897245.543002] alpha data-mesher[213]: time=2026-10-07T20:14:25.528Z level=INFO msg="peer connected" peer_id=12D3KooWSSRYsgtDV5jPaiEEwjKfV9iVCy9735tuqT1m2FSuBxqy remote_addr=/ip4/192.168.1.2/tcp/7946
container-test-run-data-mesher> alpha # [2897245.756391] alpha systemd-logind[232]: New seat seat0.
container-test-run-data-mesher> alpha # [2897245.760564] alpha systemd[1]: Started User Login Management.
container-test-run-data-mesher> alpha # [2897245.762713] alpha systemd[1]: Starting linger-users.service...
container-test-run-data-mesher> gamma # [2897245.523556] gamma data-mesher[212]: time=2026-10-07T20:14:25.509Z level=DEBUG msg="http config" listen_addresses="[[::1]:7331 127.0.0.1:7331]" port=7331 interfaces=[lo]
container-test-run-data-mesher> gamma # [2897245.528542] gamma data-mesher[212]: time=2026-10-07T20:14:25.510Z level=DEBUG msg="cluster config" port=7946 interfaces=[] bootstrap_peers="[{12D3KooWGd9GzvUzHtYYJiEeQSXw5sUKG3GwJBnRGGmdxGoWqFqD: [/dns/alpha.clan/tcp/7946]} {12D3KooWSSRYsgtDV5jPaiEEwjKfV9iVCy9735tuqT1m2FSuBxqy: [/dns/beta.clan/tcp/7946]}]" push_pull_interval=5s peer_id=12D3KooWCYLTjRnfE7mkT3YKALPu3LU6CxFNhKtCt1YKtwA9Ldnx
container-test-run-data-mesher> gamma # [2897245.528542] gamma data-mesher[212]: time=2026-10-07T20:14:25.510Z level=INFO msg="config loaded" config_file=/etc/data-mesher/dm.toml
container-test-run-data-mesher> gamma # [2897245.530028] gamma data-mesher[212]: time=2026-10-07T20:14:25.515Z level=INFO msg="checking file integrity"
container-test-run-data-mesher> gamma # [2897245.530135] gamma data-mesher[212]: time=2026-10-07T20:14:25.515Z level=INFO msg="file integrity check complete"
container-test-run-data-mesher> gamma # [2897245.533966] gamma data-mesher[212]: time=2026-10-07T20:14:25.519Z level=INFO msg="libp2p host created" peer_id=12D3KooWCYLTjRnfE7mkT3YKALPu3LU6CxFNhKtCt1YKtwA9Ldnx addresses="[/ip4/127.0.0.1/tcp/7946 /ip4/192.168.1.3/tcp/7946 /ip6/::1/tcp/7946 /ip6/2001:db8:1::3/tcp/7946]"
container-test-run-data-mesher> gamma # [2897245.534034] gamma data-mesher[212]: time=2026-10-07T20:14:25.519Z level=INFO msg="registered HTTP route" method=PUT path=/files/:name
container-test-run-data-mesher> gamma # [2897245.534034] gamma data-mesher[212]: time=2026-10-07T20:14:25.519Z level=INFO msg="registered HTTP route" method=DELETE path=/files/:name
container-test-run-data-mesher> gamma # [2897245.534034] gamma data-mesher[212]: time=2026-10-07T20:14:25.519Z level=INFO msg="registered HTTP route" method=GET path=/files
container-test-run-data-mesher> gamma # [2897245.534034] gamma data-mesher[212]: time=2026-10-07T20:14:25.519Z level=INFO msg="starting server"
container-test-run-data-mesher> gamma # [2897245.534229] gamma data-mesher[212]: time=2026-10-07T20:14:25.519Z level=INFO msg="waiting for DHT to populate" delay=10s
container-test-run-data-mesher> gamma # [2897245.534285] gamma data-mesher[212]: time=2026-10-07T20:14:25.520Z level=INFO msg="HTTP server listening" address=[::1]:7331
container-test-run-data-mesher> gamma # [2897245.534826] gamma data-mesher[212]: time=2026-10-07T20:14:25.520Z level=INFO msg="HTTP server listening" address=127.0.0.1:7331
container-test-run-data-mesher> gamma # [2897245.536138] gamma systemd-networkd[206]: eth1: Gained IPv6LL
container-test-run-data-mesher> gamma # [2897245.540575] gamma data-mesher[212]: time=2026-10-07T20:14:25.526Z level=INFO msg="peer connected" peer_id=12D3KooWGd9GzvUzHtYYJiEeQSXw5sUKG3GwJBnRGGmdxGoWqFqD remote_addr=/ip4/192.168.1.1/tcp/7946
container-test-run-data-mesher> gamma # [2897245.546127] gamma data-mesher[212]: time=2026-10-07T20:14:25.531Z level=INFO msg="peer connected" peer_id=12D3KooWSSRYsgtDV5jPaiEEwjKfV9iVCy9735tuqT1m2FSuBxqy remote_addr=/ip4/192.168.1.2/tcp/7946
container-test-run-data-mesher> gamma # [2897245.763757] gamma systemd-logind[231]: New seat seat0.
container-test-run-data-mesher> gamma # [2897245.764426] gamma systemd[1]: Started User Login Management.
container-test-run-data-mesher> gamma # [2897245.765744] gamma systemd[1]: Starting linger-users.service...
container-test-run-data-mesher> beta # [2897245.779146] beta systemd-logind[230]: New seat seat0.
container-test-run-data-mesher> beta # [2897245.780085] beta systemd[1]: Started User Login Management.
container-test-run-data-mesher> beta # [2897245.800791] beta systemd[1]: Starting linger-users.service...
container-test-run-data-mesher> beta # [2897245.815603] beta systemd[1]: linger-users.service: Deactivated successfully.
container-test-run-data-mesher> beta # [2897245.815724] beta systemd[1]: Finished linger-users.service.
container-test-run-data-mesher> alpha # [2897245.810668] alpha systemd[1]: linger-users.service: Deactivated successfully.
container-test-run-data-mesher> alpha # [2897245.810889] alpha systemd[1]: Finished linger-users.service.
container-test-run-data-mesher> gamma # [2897245.810125] gamma systemd[1]: linger-users.service: Deactivated successfully.
container-test-run-data-mesher> gamma # [2897245.810421] gamma systemd[1]: Finished linger-users.service.
container-test-run-data-mesher> alpha # [2897246.176118] alpha systemd-networkd[207]: eth1: Gained IPv6LL
container-test-run-data-mesher> alpha: still waiting for container 'alpha' to reach ready state...
container-test-run-data-mesher> alpha: (finished: waiting for unit data-mesher.service, in 13.18 seconds)
container-test-run-data-mesher> beta: waiting for unit data-mesher.service
container-test-run-data-mesher> beta: (finished: waiting for unit data-mesher.service, in 0.02 seconds)
container-test-run-data-mesher> gamma: waiting for unit data-mesher.service
container-test-run-data-mesher> gamma: (finished: waiting for unit data-mesher.service, in 0.02 seconds)
container-test-run-data-mesher> alpha: must succeed: echo -n 'hello world' > /tmp/test_file
container-test-run-data-mesher> alpha: (finished: must succeed: echo -n 'hello world' > /tmp/test_file, in 0.01 seconds)
container-test-run-data-mesher> alpha: waiting for success: data-mesher file update /tmp/test_file --network-id /nix/store/h56kg9cirw9zl1bg0wsxcryb0lz42l90-shared-data-mesher-network_network.pub --url http://[::1]:7331 --key /nix/store/xysmjnpbvgzv55l8s8ixr5y3ih9fz7qc-admin.key
container-test-run-data-mesher> alpha: (finished: waiting for success: data-mesher file update /tmp/test_file --network-id /nix/store/h56kg9cirw9zl1bg0wsxcryb0lz42l90-shared-data-mesher-network_network.pub --url http://[::1]:7331 --key /nix/store/xysmjnpbvgzv55l8s8ixr5y3ih9fz7qc-admin.key, in 0.03 seconds)
container-test-run-data-mesher> ??? Warning (UserWarning): wait_until_succeeds(): passing a bare int/float as a duration is deprecated. Use datetime.timedelta instead.
container-test-run-data-mesher>     File "/nix/store/x4i03lhka9aiwxswmbhjfzzbl77nlxmj-nixos-test-driver-1.1/lib/python3.14/site-packages/test_driver/duration.py", line 39
container-test-run-data-mesher> alpha: waiting for success: test -f /var/lib/data-mesher/files/home/test_file && grep -q 'hello world' /var/lib/data-mesher/files/home/test_file
container-test-run-data-mesher> ??? Warning (UserWarning): execute(): passing a bare int/float as a duration is deprecated. Use datetime.timedelta instead.
container-test-run-data-mesher>     File "/nix/store/x4i03lhka9aiwxswmbhjfzzbl77nlxmj-nixos-test-driver-1.1/lib/python3.14/site-packages/test_driver/duration.py", line 39
container-test-run-data-mesher> alpha: (finished: waiting for success: test -f /var/lib/data-mesher/files/home/test_file && grep -q 'hello world' /var/lib/data-mesher/files/home/test_file, in 0.01 seconds)
container-test-run-data-mesher> beta: waiting for success: test -f /var/lib/data-mesher/files/home/test_file && grep -q 'hello world' /var/lib/data-mesher/files/home/test_file
container-test-run-data-mesher> alpha # [2897255.535510] alpha data-mesher[213]: time=2026-10-07T20:14:35.521Z level=INFO msg="received state sync from peer" peer=12D3KooWCYLTjRnfE7mkT3YKALPu3LU6CxFNhKtCt1YKtwA9Ldnx
container-test-run-data-mesher> alpha # [2897255.535510] alpha data-mesher[213]: time=2026-10-07T20:14:35.521Z level=INFO msg="merging remote state" peer=12D3KooWCYLTjRnfE7mkT3YKALPu3LU6CxFNhKtCt1YKtwA9Ldnx
container-test-run-data-mesher> alpha # [2897255.536413] alpha data-mesher[213]: time=2026-10-07T20:14:35.521Z level=INFO msg="performing state exchange with peers on join" count=1
container-test-run-data-mesher> alpha # [2897255.536413] alpha data-mesher[213]: time=2026-10-07T20:14:35.521Z level=DEBUG msg="initiating state exchange" peer=12D3KooWCYLTjRnfE7mkT3YKALPu3LU6CxFNhKtCt1YKtwA9Ldnx timeout=5s
container-test-run-data-mesher> alpha # [2897255.536939] alpha data-mesher[213]: time=2026-10-07T20:14:35.522Z level=INFO msg="merging remote state" peer=12D3KooWCYLTjRnfE7mkT3YKALPu3LU6CxFNhKtCt1YKtwA9Ldnx
container-test-run-data-mesher> alpha # [2897255.536939] alpha data-mesher[213]: time=2026-10-07T20:14:35.522Z level=INFO msg="state exchange complete" peer=12D3KooWCYLTjRnfE7mkT3YKALPu3LU6CxFNhKtCt1YKtwA9Ldnx timeout=5s
container-test-run-data-mesher> alpha # [2897255.537068] alpha data-mesher[213]: time=2026-10-07T20:14:35.522Z level=INFO msg="server started"
container-test-run-data-mesher> alpha # [2897255.537161] alpha data-mesher[213]: time=2026-10-07T20:14:35.522Z level=INFO msg="starting expired-file sweeper" interval=1m0s
container-test-run-data-mesher> alpha # [2897255.537286] alpha systemd[1]: Started data mesher daemon.
container-test-run-data-mesher> alpha # [2897255.537799] alpha systemd[1]: Reached target Multi-User System.
container-test-run-data-mesher> alpha # [2897255.538104] alpha systemd[1]: Startup finished in 12.538s.
container-test-run-data-mesher> alpha # [2897255.694367] alpha data-mesher[213]: time=2026-10-07T20:14:35.680Z level=INFO msg=http_request uri=/files/test_file status=204
container-test-run-data-mesher> beta # [2897255.534088] beta data-mesher[213]: time=2026-10-07T20:14:35.519Z level=INFO msg="performing state exchange with peers on join" count=1
container-test-run-data-mesher> beta # [2897255.534088] beta data-mesher[213]: time=2026-10-07T20:14:35.519Z level=DEBUG msg="initiating state exchange" peer=12D3KooWCYLTjRnfE7mkT3YKALPu3LU6CxFNhKtCt1YKtwA9Ldnx timeout=5s
container-test-run-data-mesher> beta # [2897255.535062] beta data-mesher[213]: time=2026-10-07T20:14:35.520Z level=INFO msg="merging remote state" peer=12D3KooWCYLTjRnfE7mkT3YKALPu3LU6CxFNhKtCt1YKtwA9Ldnx
container-test-run-data-mesher> beta # [2897255.535062] beta data-mesher[213]: time=2026-10-07T20:14:35.520Z level=INFO msg="state exchange complete" peer=12D3KooWCYLTjRnfE7mkT3YKALPu3LU6CxFNhKtCt1YKtwA9Ldnx timeout=5s
container-test-run-data-mesher> beta # [2897255.535335] beta data-mesher[213]: time=2026-10-07T20:14:35.521Z level=INFO msg="server started"
container-test-run-data-mesher> beta # [2897255.535718] beta data-mesher[213]: time=2026-10-07T20:14:35.521Z level=INFO msg="starting expired-file sweeper" interval=1m0s
container-test-run-data-mesher> beta # [2897255.535825] beta systemd[1]: Started data mesher daemon.
container-test-run-data-mesher> beta # [2897255.536454] beta systemd[1]: Reached target Multi-User System.
container-test-run-data-mesher> beta # [2897255.536770] beta systemd[1]: Startup finished in 12.542s.
container-test-run-data-mesher> gamma # [2897255.535008] gamma data-mesher[212]: time=2026-10-07T20:14:35.520Z level=INFO msg="performing state exchange with peers on join" count=1
container-test-run-data-mesher> gamma # [2897255.535008] gamma data-mesher[212]: time=2026-10-07T20:14:35.520Z level=DEBUG msg="initiating state exchange" peer=12D3KooWGd9GzvUzHtYYJiEeQSXw5sUKG3GwJBnRGGmdxGoWqFqD timeout=5s
container-test-run-data-mesher> gamma # [2897255.535008] gamma data-mesher[212]: time=2026-10-07T20:14:35.520Z level=INFO msg="received state sync from peer" peer=12D3KooWSSRYsgtDV5jPaiEEwjKfV9iVCy9735tuqT1m2FSuBxqy
container-test-run-data-mesher> gamma # [2897255.535008] gamma data-mesher[212]: time=2026-10-07T20:14:35.520Z level=INFO msg="merging remote state" peer=12D3KooWSSRYsgtDV5jPaiEEwjKfV9iVCy9735tuqT1m2FSuBxqy
container-test-run-data-mesher> gamma # [2897255.536036] gamma data-mesher[212]: time=2026-10-07T20:14:35.521Z level=INFO msg="merging remote state" peer=12D3KooWGd9GzvUzHtYYJiEeQSXw5sUKG3GwJBnRGGmdxGoWqFqD
container-test-run-data-mesher> gamma # [2897255.536036] gamma data-mesher[212]: time=2026-10-07T20:14:35.521Z level=INFO msg="state exchange complete" peer=12D3KooWGd9GzvUzHtYYJiEeQSXw5sUKG3GwJBnRGGmdxGoWqFqD timeout=5s
container-test-run-data-mesher> gamma # [2897255.536180] gamma data-mesher[212]: time=2026-10-07T20:14:35.521Z level=INFO msg="server started"
container-test-run-data-mesher> gamma # [2897255.536400] gamma systemd[1]: Started data mesher daemon.
container-test-run-data-mesher> gamma # [2897255.536914] gamma systemd[1]: Reached target Multi-User System.
container-test-run-data-mesher> gamma # [2897255.537078] gamma data-mesher[212]: time=2026-10-07T20:14:35.522Z level=INFO msg="starting expired-file sweeper" interval=1m0s
container-test-run-data-mesher> gamma # [2897255.537078] gamma data-mesher[212]: time=2026-10-07T20:14:35.522Z level=INFO msg="received state sync from peer" peer=12D3KooWGd9GzvUzHtYYJiEeQSXw5sUKG3GwJBnRGGmdxGoWqFqD
container-test-run-data-mesher> gamma # [2897255.537078] gamma data-mesher[212]: time=2026-10-07T20:14:35.522Z level=INFO msg="merging remote state" peer=12D3KooWGd9GzvUzHtYYJiEeQSXw5sUKG3GwJBnRGGmdxGoWqFqD
container-test-run-data-mesher> gamma # [2897255.537201] gamma systemd[1]: Startup finished in 12.529s.
container-test-run-data-mesher> beta: (finished: waiting for success: test -f /var/lib/data-mesher/files/home/test_file && grep -q 'hello world' /var/lib/data-mesher/files/home/test_file, in 5.05 seconds)
container-test-run-data-mesher> gamma: waiting for success: test -f /var/lib/data-mesher/files/home/test_file && grep -q 'hello world' /var/lib/data-mesher/files/home/test_file
container-test-run-data-mesher> gamma: (finished: waiting for success: test -f /var/lib/data-mesher/files/home/test_file && grep -q 'hello world' /var/lib/data-mesher/files/home/test_file, in 0.01 seconds)
container-test-run-data-mesher> beta: waiting for success: data-mesher file delete test_file --network-id /nix/store/h56kg9cirw9zl1bg0wsxcryb0lz42l90-shared-data-mesher-network_network.pub --url http://[::1]:7331 --key /nix/store/xysmjnpbvgzv55l8s8ixr5y3ih9fz7qc-admin.key
container-test-run-data-mesher> alpha # [2897260.538121] alpha data-mesher[213]: time=2026-10-07T20:14:40.523Z level=DEBUG msg="attempting push/pull" peer_count=2
container-test-run-data-mesher> alpha # [2897260.538829] alpha data-mesher[213]: time=2026-10-07T20:14:40.523Z level=DEBUG msg="initiating state exchange" peer=12D3KooWCYLTjRnfE7mkT3YKALPu3LU6CxFNhKtCt1YKtwA9Ldnx timeout=5s
container-test-run-data-mesher> alpha # [2897260.538829] alpha data-mesher[213]: time=2026-10-07T20:14:40.524Z level=INFO msg="received state sync from peer" peer=12D3KooWSSRYsgtDV5jPaiEEwjKfV9iVCy9735tuqT1m2FSuBxqy
container-test-run-data-mesher> alpha # [2897260.538829] alpha data-mesher[213]: time=2026-10-07T20:14:40.524Z level=INFO msg="merging remote state" peer=12D3KooWSSRYsgtDV5jPaiEEwjKfV9iVCy9735tuqT1m2FSuBxqy
container-test-run-data-mesher> alpha # [2897260.538829] alpha data-mesher[213]: time=2026-10-07T20:14:40.524Z level=INFO msg="received state sync from peer" peer=12D3KooWCYLTjRnfE7mkT3YKALPu3LU6CxFNhKtCt1YKtwA9Ldnx
container-test-run-data-mesher> alpha # [2897260.538829] alpha data-mesher[213]: time=2026-10-07T20:14:40.524Z level=INFO msg="merging remote state" peer=12D3KooWCYLTjRnfE7mkT3YKALPu3LU6CxFNhKtCt1YKtwA9Ldnx
container-test-run-data-mesher> alpha # [2897260.539484] alpha data-mesher[213]: time=2026-10-07T20:14:40.525Z level=INFO msg="merging remote state" peer=12D3KooWCYLTjRnfE7mkT3YKALPu3LU6CxFNhKtCt1YKtwA9Ldnx
container-test-run-data-mesher> alpha # [2897260.539484] alpha data-mesher[213]: time=2026-10-07T20:14:40.525Z level=INFO msg="received file request" peer=12D3KooWSSRYsgtDV5jPaiEEwjKfV9iVCy9735tuqT1m2FSuBxqy network="w/mxYnixxoBkpYcDj7p5HyX7UwN+MIX5iU6Br4MQDEo=" name=test_file
container-test-run-data-mesher> alpha # [2897260.539610] alpha data-mesher[213]: time=2026-10-07T20:14:40.525Z level=INFO msg="state exchange complete" peer=12D3KooWCYLTjRnfE7mkT3YKALPu3LU6CxFNhKtCt1YKtwA9Ldnx timeout=5s
container-test-run-data-mesher> alpha # [2897260.539675] alpha data-mesher[213]: time=2026-10-07T20:14:40.525Z level=DEBUG msg="push/pull successful" interval=5s
container-test-run-data-mesher> alpha # [2897260.539850] alpha data-mesher[213]: time=2026-10-07T20:14:40.525Z level=INFO msg="received file request" peer=12D3KooWCYLTjRnfE7mkT3YKALPu3LU6CxFNhKtCt1YKtwA9Ldnx network="w/mxYnixxoBkpYcDj7p5HyX7UwN+MIX5iU6Br4MQDEo=" name=test_file
container-test-run-data-mesher> alpha # [2897260.542159] alpha data-mesher[213]: time=2026-10-07T20:14:40.527Z level=INFO msg="file transfer complete" peer=12D3KooWSSRYsgtDV5jPaiEEwjKfV9iVCy9735tuqT1m2FSuBxqy network="w/mxYnixxoBkpYcDj7p5HyX7UwN+MIX5iU6Br4MQDEo=" name=test_file
container-test-run-data-mesher> alpha # [2897260.542251] alpha data-mesher[213]: time=2026-10-07T20:14:40.528Z level=INFO msg="file transfer complete" peer=12D3KooWCYLTjRnfE7mkT3YKALPu3LU6CxFNhKtCt1YKtwA9Ldnx network="w/mxYnixxoBkpYcDj7p5HyX7UwN+MIX5iU6Br4MQDEo=" name=test_file
container-test-run-data-mesher> beta # [2897260.537579] beta data-mesher[213]: time=2026-10-07T20:14:40.523Z level=DEBUG msg="attempting push/pull" peer_count=2
container-test-run-data-mesher> beta # [2897260.537579] beta data-mesher[213]: time=2026-10-07T20:14:40.523Z level=DEBUG msg="initiating state exchange" peer=12D3KooWGd9GzvUzHtYYJiEeQSXw5sUKG3GwJBnRGGmdxGoWqFqD timeout=5s
container-test-run-data-mesher> beta # [2897260.538746] beta data-mesher[213]: time=2026-10-07T20:14:40.524Z level=INFO msg="merging remote state" peer=12D3KooWGd9GzvUzHtYYJiEeQSXw5sUKG3GwJBnRGGmdxGoWqFqD
container-test-run-data-mesher> beta # [2897260.538827] beta data-mesher[213]: time=2026-10-07T20:14:40.524Z level=DEBUG msg="new file detected" peer=12D3KooWGd9GzvUzHtYYJiEeQSXw5sUKG3GwJBnRGGmdxGoWqFqD name=test_file name=test_file
container-test-run-data-mesher> beta # [2897260.538827] beta data-mesher[213]: time=2026-10-07T20:14:40.524Z level=INFO msg="state exchange complete" peer=12D3KooWGd9GzvUzHtYYJiEeQSXw5sUKG3GwJBnRGGmdxGoWqFqD timeout=5s
container-test-run-data-mesher> beta # [2897260.538942] beta data-mesher[213]: time=2026-10-07T20:14:40.524Z level=DEBUG msg="push/pull successful" interval=5s
container-test-run-data-mesher> beta # [2897260.538942] beta data-mesher[213]: time=2026-10-07T20:14:40.524Z level=INFO msg="scheduling file download" name=test_file
container-test-run-data-mesher> beta # [2897260.538942] beta data-mesher[213]: time=2026-10-07T20:14:40.524Z level=INFO msg="downloading file" name=test_file signed_at="2026-10-07 20:14:35.675 +0000 UTC" signed_by="azwT+VhTxA+BF73Hwq0uqdXHG8XvHU2BknoVXgmEjww=" peer=12D3KooWGd9GzvUzHtYYJiEeQSXw5sUKG3GwJBnRGGmdxGoWqFqD
container-test-run-data-mesher> beta # [2897260.639396] beta data-mesher[213]: time=2026-10-07T20:14:40.625Z level=INFO msg="download complete" name=test_file signed_at="2026-10-07 20:14:35.675 +0000 UTC" signed_by="azwT+VhTxA+BF73Hwq0uqdXHG8XvHU2BknoVXgmEjww=" peer=12D3KooWGd9GzvUzHtYYJiEeQSXw5sUKG3GwJBnRGGmdxGoWqFqD written=true elapsed=100.446195ms
container-test-run-data-mesher> beta # [2897260.796486] beta data-mesher[213]: time=2026-10-07T20:14:40.782Z level=INFO msg=http_request uri=/files/test_file status=204
container-test-run-data-mesher> beta: (finished: waiting for success: data-mesher file delete test_file --network-id /nix/store/h56kg9cirw9zl1bg0wsxcryb0lz42l90-shared-data-mesher-network_network.pub --url http://[::1]:7331 --key /nix/store/xysmjnpbvgzv55l8s8ixr5y3ih9fz7qc-admin.key, in 0.03 seconds)
container-test-run-data-mesher> alpha: waiting for success: test ! -f /var/lib/data-mesher/files/home/test_file
container-test-run-data-mesher> gamma # [2897260.538338] gamma data-mesher[212]: time=2026-10-07T20:14:40.524Z level=DEBUG msg="attempting push/pull" peer_count=2
container-test-run-data-mesher> gamma # [2897260.538338] gamma data-mesher[212]: time=2026-10-07T20:14:40.524Z level=DEBUG msg="initiating state exchange" peer=12D3KooWGd9GzvUzHtYYJiEeQSXw5sUKG3GwJBnRGGmdxGoWqFqD timeout=5s
container-test-run-data-mesher> gamma # [2897260.539068] gamma data-mesher[212]: time=2026-10-07T20:14:40.524Z level=INFO msg="received state sync from peer" peer=12D3KooWGd9GzvUzHtYYJiEeQSXw5sUKG3GwJBnRGGmdxGoWqFqD
container-test-run-data-mesher> gamma # [2897260.539068] gamma data-mesher[212]: time=2026-10-07T20:14:40.524Z level=INFO msg="merging remote state" peer=12D3KooWGd9GzvUzHtYYJiEeQSXw5sUKG3GwJBnRGGmdxGoWqFqD
container-test-run-data-mesher> gamma # [2897260.539183] gamma data-mesher[212]: time=2026-10-07T20:14:40.524Z level=DEBUG msg="new file detected" peer=12D3KooWGd9GzvUzHtYYJiEeQSXw5sUKG3GwJBnRGGmdxGoWqFqD name=test_file name=test_file
container-test-run-data-mesher> gamma # [2897260.539311] gamma data-mesher[212]: time=2026-10-07T20:14:40.525Z level=INFO msg="scheduling file download" name=test_file
container-test-run-data-mesher> gamma # [2897260.539393] gamma data-mesher[212]: time=2026-10-07T20:14:40.525Z level=INFO msg="downloading file" name=test_file signed_at="2026-10-07 20:14:35.675 +0000 UTC" signed_by="azwT+VhTxA+BF73Hwq0uqdXHG8XvHU2BknoVXgmEjww=" peer=12D3KooWGd9GzvUzHtYYJiEeQSXw5sUKG3GwJBnRGGmdxGoWqFqD
container-test-run-data-mesher> gamma # [2897260.539502] gamma data-mesher[212]: time=2026-10-07T20:14:40.525Z level=INFO msg="merging remote state" peer=12D3KooWGd9GzvUzHtYYJiEeQSXw5sUKG3GwJBnRGGmdxGoWqFqD
container-test-run-data-mesher> gamma # [2897260.539502] gamma data-mesher[212]: time=2026-10-07T20:14:40.525Z level=DEBUG msg="new file detected" peer=12D3KooWGd9GzvUzHtYYJiEeQSXw5sUKG3GwJBnRGGmdxGoWqFqD name=test_file name=test_file
container-test-run-data-mesher> gamma # [2897260.539624] gamma data-mesher[212]: time=2026-10-07T20:14:40.525Z level=INFO msg="state exchange complete" peer=12D3KooWGd9GzvUzHtYYJiEeQSXw5sUKG3GwJBnRGGmdxGoWqFqD timeout=5s
container-test-run-data-mesher> gamma # [2897260.539624] gamma data-mesher[212]: time=2026-10-07T20:14:40.525Z level=DEBUG msg="push/pull successful" interval=5s
container-test-run-data-mesher> gamma # [2897260.639309] gamma data-mesher[212]: time=2026-10-07T20:14:40.625Z level=INFO msg="download complete" name=test_file signed_at="2026-10-07 20:14:35.675 +0000 UTC" signed_by="azwT+VhTxA+BF73Hwq0uqdXHG8XvHU2BknoVXgmEjww=" peer=12D3KooWGd9GzvUzHtYYJiEeQSXw5sUKG3GwJBnRGGmdxGoWqFqD written=true elapsed=99.955909ms
container-test-run-data-mesher> alpha: (finished: waiting for success: test ! -f /var/lib/data-mesher/files/home/test_file, in 5.04 seconds)
container-test-run-data-mesher> beta: waiting for success: test ! -f /var/lib/data-mesher/files/home/test_file
container-test-run-data-mesher> beta: (finished: waiting for success: test ! -f /var/lib/data-mesher/files/home/test_file, in 0.01 seconds)
container-test-run-data-mesher> gamma: waiting for success: test ! -f /var/lib/data-mesher/files/home/test_file
container-test-run-data-mesher> gamma: (finished: waiting for success: test ! -f /var/lib/data-mesher/files/home/test_file, in 0.01 seconds)
container-test-run-data-mesher> alpha: must succeed: cat /nix/store/rkg8ns07vqwiznyw8haaaskp5hxlcsis-per-machine-alpha-data-mesher-node-identity_identity.pub
container-test-run-data-mesher> alpha: (finished: must succeed: cat /nix/store/rkg8ns07vqwiznyw8haaaskp5hxlcsis-per-machine-alpha-data-mesher-node-identity_identity.pub, in 0.01 seconds)
container-test-run-data-mesher> alpha: must succeed: echo -n 'namespace_data' > /tmp/ns_file
container-test-run-data-mesher> beta # [2897265.539649] beta data-mesher[213]: time=2026-10-07T20:14:45.525Z level=DEBUG msg="attempting push/pull" peer_count=2
container-test-run-data-mesher> beta # [2897265.539649] beta data-mesher[213]: time=2026-10-07T20:14:45.525Z level=DEBUG msg="initiating state exchange" peer=12D3KooWGd9GzvUzHtYYJiEeQSXw5sUKG3GwJBnRGGmdxGoWqFqD timeout=5s
container-test-run-data-mesher> beta # [2897265.540533] beta data-mesher[213]: time=2026-10-07T20:14:45.526Z level=INFO msg="received state sync from peer" peer=12D3KooWCYLTjRnfE7mkT3YKALPu3LU6CxFNhKtCt1YKtwA9Ldnx
container-test-run-data-mesher> beta # [2897265.540533] beta data-mesher[213]: time=2026-10-07T20:14:45.526Z level=INFO msg="merging remote state" peer=12D3KooWCYLTjRnfE7mkT3YKALPu3LU6CxFNhKtCt1YKtwA9Ldnx
container-test-run-data-mesher> beta # [2897265.542993] beta data-mesher[213]: time=2026-10-07T20:14:45.528Z level=INFO msg="merging remote state" peer=12D3KooWGd9GzvUzHtYYJiEeQSXw5sUKG3GwJBnRGGmdxGoWqFqD
container-test-run-data-mesher> beta # [2897265.543069] beta data-mesher[213]: time=2026-10-07T20:14:45.528Z level=INFO msg="state exchange complete" peer=12D3KooWGd9GzvUzHtYYJiEeQSXw5sUKG3GwJBnRGGmdxGoWqFqD timeout=5s
container-test-run-data-mesher> beta # [2897265.543069] beta data-mesher[213]: time=2026-10-07T20:14:45.528Z level=DEBUG msg="push/pull successful" interval=5s
container-test-run-data-mesher> alpha: (finished: must succeed: echo -n 'namespace_data' > /tmp/ns_file, in 0.01 seconds)
container-test-run-data-mesher> alpha: waiting for success: data-mesher file update /tmp/ns_file --name 'test_ns/ZSHXpiLZm7gXydOj2hiong0JlgLR52ymKrbj3Sq89zQ' --url http://[::1]:7331 --key /run/secrets/per-machine/alpha/data-mesher-node-identity/identity.key --network-id /nix/store/h56kg9cirw9zl1bg0wsxcryb0lz42l90-shared-data-mesher-network_network.pub --cert /run/secrets/per-machine/alpha/data-mesher-node-identity/identity.cert
container-test-run-data-mesher> alpha # [2897265.540229] alpha data-mesher[213]: time=2026-10-07T20:14:45.525Z level=DEBUG msg="attempting push/pull" peer_count=2
container-test-run-data-mesher> alpha # [2897265.540229] alpha data-mesher[213]: time=2026-10-07T20:14:45.526Z level=DEBUG msg="initiating state exchange" peer=12D3KooWCYLTjRnfE7mkT3YKALPu3LU6CxFNhKtCt1YKtwA9Ldnx timeout=5s
container-test-run-data-mesher> alpha # [2897265.541026] alpha data-mesher[213]: time=2026-10-07T20:14:45.526Z level=INFO msg="received state sync from peer" peer=12D3KooWSSRYsgtDV5jPaiEEwjKfV9iVCy9735tuqT1m2FSuBxqy
container-test-run-data-mesher> alpha # [2897265.541026] alpha data-mesher[213]: time=2026-10-07T20:14:45.526Z level=INFO msg="merging remote state" peer=12D3KooWSSRYsgtDV5jPaiEEwjKfV9iVCy9735tuqT1m2FSuBxqy
container-test-run-data-mesher> alpha # [2897265.541286] alpha data-mesher[213]: time=2026-10-07T20:14:45.527Z level=INFO msg="merging remote state" peer=12D3KooWCYLTjRnfE7mkT3YKALPu3LU6CxFNhKtCt1YKtwA9Ldnx
container-test-run-data-mesher> alpha # [2897265.541359] alpha data-mesher[213]: time=2026-10-07T20:14:45.527Z level=INFO msg="state exchange complete" peer=12D3KooWCYLTjRnfE7mkT3YKALPu3LU6CxFNhKtCt1YKtwA9Ldnx timeout=5s
container-test-run-data-mesher> alpha # [2897265.541418] alpha data-mesher[213]: time=2026-10-07T20:14:45.527Z level=DEBUG msg="push/pull successful" interval=5s
container-test-run-data-mesher> alpha # [2897265.542661] alpha data-mesher[213]: time=2026-10-07T20:14:45.528Z level=DEBUG msg="imported tombstone" peer=12D3KooWSSRYsgtDV5jPaiEEwjKfV9iVCy9735tuqT1m2FSuBxqy name=test_file written=true
container-test-run-data-mesher> alpha # [2897265.904414] alpha data-mesher[213]: time=2026-10-07T20:14:45.890Z level=INFO msg=http_request uri=/files/test_ns/ZSHXpiLZm7gXydOj2hiong0JlgLR52ymKrbj3Sq89zQ status=204
container-test-run-data-mesher> alpha: (finished: waiting for success: data-mesher file update /tmp/ns_file --name 'test_ns/ZSHXpiLZm7gXydOj2hiong0JlgLR52ymKrbj3Sq89zQ' --url http://[::1]:7331 --key /run/secrets/per-machine/alpha/data-mesher-node-identity/identity.key --network-id /nix/store/h56kg9cirw9zl1bg0wsxcryb0lz42l90-shared-data-mesher-network_network.pub --cert /run/secrets/per-machine/alpha/data-mesher-node-identity/identity.cert, in 0.03 seconds)
container-test-run-data-mesher> alpha: waiting for success: test -f /var/lib/data-mesher/files/home/test_ns/ZSHXpiLZm7gXydOj2hiong0JlgLR52ymKrbj3Sq89zQ && grep -q 'namespace_data' /var/lib/data-mesher/files/home/test_ns/ZSHXpiLZm7gXydOj2hiong0JlgLR52ymKrbj3Sq89zQ
container-test-run-data-mesher> alpha: (finished: waiting for success: test -f /var/lib/data-mesher/files/home/test_ns/ZSHXpiLZm7gXydOj2hiong0JlgLR52ymKrbj3Sq89zQ && grep -q 'namespace_data' /var/lib/data-mesher/files/home/test_ns/ZSHXpiLZm7gXydOj2hiong0JlgLR52ymKrbj3Sq89zQ, in 0.01 seconds)
container-test-run-data-mesher> beta: waiting for success: test -f /var/lib/data-mesher/files/home/test_ns/ZSHXpiLZm7gXydOj2hiong0JlgLR52ymKrbj3Sq89zQ && grep -q 'namespace_data' /var/lib/data-mesher/files/home/test_ns/ZSHXpiLZm7gXydOj2hiong0JlgLR52ymKrbj3Sq89zQ
container-test-run-data-mesher> gamma # [2897265.539927] gamma data-mesher[212]: time=2026-10-07T20:14:45.525Z level=DEBUG msg="attempting push/pull" peer_count=2
container-test-run-data-mesher> gamma # [2897265.539927] gamma data-mesher[212]: time=2026-10-07T20:14:45.525Z level=DEBUG msg="initiating state exchange" peer=12D3KooWSSRYsgtDV5jPaiEEwjKfV9iVCy9735tuqT1m2FSuBxqy timeout=5s
container-test-run-data-mesher> gamma # [2897265.540952] gamma data-mesher[212]: time=2026-10-07T20:14:45.526Z level=INFO msg="received state sync from peer" peer=12D3KooWGd9GzvUzHtYYJiEeQSXw5sUKG3GwJBnRGGmdxGoWqFqD
container-test-run-data-mesher> gamma # [2897265.540952] gamma data-mesher[212]: time=2026-10-07T20:14:45.526Z level=INFO msg="merging remote state" peer=12D3KooWGd9GzvUzHtYYJiEeQSXw5sUKG3GwJBnRGGmdxGoWqFqD
container-test-run-data-mesher> gamma # [2897265.541084] gamma data-mesher[212]: time=2026-10-07T20:14:45.526Z level=INFO msg="merging remote state" peer=12D3KooWSSRYsgtDV5jPaiEEwjKfV9iVCy9735tuqT1m2FSuBxqy
container-test-run-data-mesher> gamma # [2897265.543225] gamma data-mesher[212]: time=2026-10-07T20:14:45.529Z level=DEBUG msg="imported tombstone" peer=12D3KooWSSRYsgtDV5jPaiEEwjKfV9iVCy9735tuqT1m2FSuBxqy name=test_file written=true
container-test-run-data-mesher> gamma # [2897265.543225] gamma data-mesher[212]: time=2026-10-07T20:14:45.529Z level=INFO msg="state exchange complete" peer=12D3KooWSSRYsgtDV5jPaiEEwjKfV9iVCy9735tuqT1m2FSuBxqy timeout=5s
container-test-run-data-mesher> gamma # [2897265.543344] gamma data-mesher[212]: time=2026-10-07T20:14:45.529Z level=DEBUG msg="push/pull successful" interval=5s
container-test-run-data-mesher> beta # [2897270.542888] beta data-mesher[213]: time=2026-10-07T20:14:50.528Z level=INFO msg="received state sync from peer" peer=12D3KooWGd9GzvUzHtYYJiEeQSXw5sUKG3GwJBnRGGmdxGoWqFqD
container-test-run-data-mesher> beta # [2897270.542888] beta data-mesher[213]: time=2026-10-07T20:14:50.528Z level=INFO msg="merging remote state" peer=12D3KooWGd9GzvUzHtYYJiEeQSXw5sUKG3GwJBnRGGmdxGoWqFqD
container-test-run-data-mesher> beta # [2897270.543673] beta data-mesher[213]: time=2026-10-07T20:14:50.529Z level=DEBUG msg="new file detected" peer=12D3KooWGd9GzvUzHtYYJiEeQSXw5sUKG3GwJBnRGGmdxGoWqFqD name=test_file name=test_ns/ZSHXpiLZm7gXydOj2hiong0JlgLR52ymKrbj3Sq89zQ name=test_ns/ZSHXpiLZm7gXydOj2hiong0JlgLR52ymKrbj3Sq89zQ
container-test-run-data-mesher> beta # [2897270.543673] beta data-mesher[213]: time=2026-10-07T20:14:50.529Z level=INFO msg="scheduling file download" name=test_ns/ZSHXpiLZm7gXydOj2hiong0JlgLR52ymKrbj3Sq89zQ
container-test-run-data-mesher> beta # [2897270.543785] beta data-mesher[213]: time=2026-10-07T20:14:50.529Z level=DEBUG msg="attempting push/pull" peer_count=2
container-test-run-data-mesher> beta # [2897270.543785] beta data-mesher[213]: time=2026-10-07T20:14:50.529Z level=INFO msg="downloading file" name=test_ns/ZSHXpiLZm7gXydOj2hiong0JlgLR52ymKrbj3Sq89zQ signed_at="2026-10-07 20:14:45.887 +0000 UTC" signed_by="ZSHXpiLZm7gXydOj2hiong0JlgLR52ymKrbj3Sq89zQ=" peer=12D3KooWGd9GzvUzHtYYJiEeQSXw5sUKG3GwJBnRGGmdxGoWqFqD
container-test-run-data-mesher> beta # [2897270.543785] beta data-mesher[213]: time=2026-10-07T20:14:50.529Z level=DEBUG msg="initiating state exchange" peer=12D3KooWCYLTjRnfE7mkT3YKALPu3LU6CxFNhKtCt1YKtwA9Ldnx timeout=5s
container-test-run-data-mesher> beta # [2897270.544707] beta data-mesher[213]: time=2026-10-07T20:14:50.530Z level=INFO msg="merging remote state" peer=12D3KooWCYLTjRnfE7mkT3YKALPu3LU6CxFNhKtCt1YKtwA9Ldnx
container-test-run-data-mesher> beta # [2897270.544707] beta data-mesher[213]: time=2026-10-07T20:14:50.530Z level=INFO msg="state exchange complete" peer=12D3KooWCYLTjRnfE7mkT3YKALPu3LU6CxFNhKtCt1YKtwA9Ldnx timeout=5s
container-test-run-data-mesher> beta # [2897270.544892] beta data-mesher[213]: time=2026-10-07T20:14:50.530Z level=DEBUG msg="push/pull successful" interval=5s
container-test-run-data-mesher> beta # [2897270.547713] beta data-mesher[213]: time=2026-10-07T20:14:50.533Z level=INFO msg="download complete" name=test_ns/ZSHXpiLZm7gXydOj2hiong0JlgLR52ymKrbj3Sq89zQ signed_at="2026-10-07 20:14:45.887 +0000 UTC" signed_by="ZSHXpiLZm7gXydOj2hiong0JlgLR52ymKrbj3Sq89zQ=" peer=12D3KooWGd9GzvUzHtYYJiEeQSXw5sUKG3GwJBnRGGmdxGoWqFqD written=true elapsed=3.977695ms
container-test-run-data-mesher> beta: (finished: waiting for success: test -f /var/lib/data-mesher/files/home/test_ns/ZSHXpiLZm7gXydOj2hiong0JlgLR52ymKrbj3Sq89zQ && grep -q 'namespace_data' /var/lib/data-mesher/files/home/test_ns/ZSHXpiLZm7gXydOj2hiong0JlgLR52ymKrbj3Sq89zQ, in 5.05 seconds)
container-test-run-data-mesher> gamma: waiting for success: test -f /var/lib/data-mesher/files/home/test_ns/ZSHXpiLZm7gXydOj2hiong0JlgLR52ymKrbj3Sq89zQ && grep -q 'namespace_data' /var/lib/data-mesher/files/home/test_ns/ZSHXpiLZm7gXydOj2hiong0JlgLR52ymKrbj3Sq89zQ
container-test-run-data-mesher> gamma: (finished: waiting for success: test -f /var/lib/data-mesher/files/home/test_ns/ZSHXpiLZm7gXydOj2hiong0JlgLR52ymKrbj3Sq89zQ && grep -q 'namespace_data' /var/lib/data-mesher/files/home/test_ns/ZSHXpiLZm7gXydOj2hiong0JlgLR52ymKrbj3Sq89zQ, in 0.01 seconds)
container-test-run-data-mesher> alpha: must succeed: echo -n 'no_cert' > /tmp/ns_nocert
container-test-run-data-mesher> alpha: (finished: must succeed: echo -n 'no_cert' > /tmp/ns_nocert, in 0.01 seconds)
container-test-run-data-mesher> alpha: must fail: data-mesher file update /tmp/ns_nocert --name 'test_ns/ZSHXpiLZm7gXydOj2hiong0JlgLR52ymKrbj3Sq89zQ' --url http://[::1]:7331 --key /run/secrets/per-machine/alpha/data-mesher-node-identity/identity.key --network-id /nix/store/h56kg9cirw9zl1bg0wsxcryb0lz42l90-shared-data-mesher-network_network.pub
container-test-run-data-mesher> gamma # [2897270.543938] gamma data-mesher[212]: time=2026-10-07T20:14:50.529Z level=DEBUG msg="attempting push/pull" peer_count=2
container-test-run-data-mesher> gamma # [2897270.544721] gamma data-mesher[212]: time=2026-10-07T20:14:50.529Z level=DEBUG msg="initiating state exchange" peer=12D3KooWGd9GzvUzHtYYJiEeQSXw5sUKG3GwJBnRGGmdxGoWqFqD timeout=5s
container-test-run-data-mesher> gamma # [2897270.544721] gamma data-mesher[212]: time=2026-10-07T20:14:50.530Z level=INFO msg="received state sync from peer" peer=12D3KooWSSRYsgtDV5jPaiEEwjKfV9iVCy9735tuqT1m2FSuBxqy
container-test-run-data-mesher> gamma # [2897270.544721] gamma data-mesher[212]: time=2026-10-07T20:14:50.530Z level=INFO msg="merging remote state" peer=12D3KooWSSRYsgtDV5jPaiEEwjKfV9iVCy9735tuqT1m2FSuBxqy
container-test-run-data-mesher> gamma # [2897270.546157] gamma data-mesher[212]: time=2026-10-07T20:14:50.531Z level=INFO msg="merging remote state" peer=12D3KooWGd9GzvUzHtYYJiEeQSXw5sUKG3GwJBnRGGmdxGoWqFqD
container-test-run-data-mesher> gamma # [2897270.546746] gamma data-mesher[212]: time=2026-10-07T20:14:50.532Z level=DEBUG msg="new file detected" peer=12D3KooWGd9GzvUzHtYYJiEeQSXw5sUKG3GwJBnRGGmdxGoWqFqD name=test_file name=test_ns/ZSHXpiLZm7gXydOj2hiong0JlgLR52ymKrbj3Sq89zQ name=test_ns/ZSHXpiLZm7gXydOj2hiong0JlgLR52ymKrbj3Sq89zQ
container-test-run-data-mesher> gamma # [2897270.546746] gamma data-mesher[212]: time=2026-10-07T20:14:50.532Z level=INFO msg="state exchange complete" peer=12D3KooWGd9GzvUzHtYYJiEeQSXw5sUKG3GwJBnRGGmdxGoWqFqD timeout=5s
container-test-run-data-mesher> gamma # [2897270.546942] gamma data-mesher[212]: time=2026-10-07T20:14:50.532Z level=DEBUG msg="push/pull successful" interval=5s
container-test-run-data-mesher> gamma # [2897270.546942] gamma data-mesher[212]: time=2026-10-07T20:14:50.532Z level=INFO msg="scheduling file download" name=test_ns/ZSHXpiLZm7gXydOj2hiong0JlgLR52ymKrbj3Sq89zQ
container-test-run-data-mesher> gamma # [2897270.547044] gamma data-mesher[212]: time=2026-10-07T20:14:50.532Z level=INFO msg="downloading file" name=test_ns/ZSHXpiLZm7gXydOj2hiong0JlgLR52ymKrbj3Sq89zQ signed_at="2026-10-07 20:14:45.887 +0000 UTC" signed_by="ZSHXpiLZm7gXydOj2hiong0JlgLR52ymKrbj3Sq89zQ=" peer=12D3KooWGd9GzvUzHtYYJiEeQSXw5sUKG3GwJBnRGGmdxGoWqFqD
container-test-run-data-mesher> gamma # [2897270.549835] gamma data-mesher[212]: time=2026-10-07T20:14:50.535Z level=INFO msg="download complete" name=test_ns/ZSHXpiLZm7gXydOj2hiong0JlgLR52ymKrbj3Sq89zQ signed_at="2026-10-07 20:14:45.887 +0000 UTC" signed_by="ZSHXpiLZm7gXydOj2hiong0JlgLR52ymKrbj3Sq89zQ=" peer=12D3KooWGd9GzvUzHtYYJiEeQSXw5sUKG3GwJBnRGGmdxGoWqFqD written=true elapsed=2.87088ms
container-test-run-data-mesher> alpha # [2897270.542114] alpha data-mesher[213]: time=2026-10-07T20:14:50.527Z level=DEBUG msg="attempting push/pull" peer_count=2
container-test-run-data-mesher> alpha # [2897270.542114] alpha data-mesher[213]: time=2026-10-07T20:14:50.527Z level=DEBUG msg="initiating state exchange" peer=12D3KooWSSRYsgtDV5jPaiEEwjKfV9iVCy9735tuqT1m2FSuBxqy timeout=5s
container-test-run-data-mesher> alpha # [2897270.543856] alpha data-mesher[213]: time=2026-10-07T20:14:50.529Z level=INFO msg="merging remote state" peer=12D3KooWSSRYsgtDV5jPaiEEwjKfV9iVCy9735tuqT1m2FSuBxqy
container-test-run-data-mesher> alpha # [2897270.543856] alpha data-mesher[213]: time=2026-10-07T20:14:50.529Z level=INFO msg="state exchange complete" peer=12D3KooWSSRYsgtDV5jPaiEEwjKfV9iVCy9735tuqT1m2FSuBxqy timeout=5s
container-test-run-data-mesher> alpha # [2897270.544124] alpha data-mesher[213]: time=2026-10-07T20:14:50.529Z level=DEBUG msg="push/pull successful" interval=5s
container-test-run-data-mesher> Error: failed to update file: 403 Forbidden, signer ZSHXpiLZm7gXydOj2hiong0JlgLR52ymKrbj3Sq89zQ= is not authorized for this file test_ns/ZSHXpiLZm7gXydOj2hiong0JlgLR52ymKrbj3Sq89zQ
container-test-run-data-mesher> alpha # [2897270.544320] alpha data-mesher[213]: time=2026-10-07T20:14:50.530Z level=INFO msg="received file request" peer=12D3KooWSSRYsgtDV5jPaiEEwjKfV9iVCy9735tuqT1m2FSuBxqy network="w/mxYnixxoBkpYcDj7p5HyX7UwN+MIX5iU6Br4MQDEo=" name=test_ns/ZSHXpiLZm7gXydOj2hiong0JlgLR52ymKrbj3Sq89zQ
container-test-run-data-mesher> alpha # [2897270.545132] alpha data-mesher[213]: time=2026-10-07T20:14:50.530Z level=INFO msg="file transfer complete" peer=12D3KooWSSRYsgtDV5jPaiEEwjKfV9iVCy9735tuqT1m2FSuBxqy network="w/mxYnixxoBkpYcDj7p5HyX7UwN+MIX5iU6Br4MQDEo=" name=test_ns/ZSHXpiLZm7gXydOj2hiong0JlgLR52ymKrbj3Sq89zQ
container-test-run-data-mesher> alpha # [2897270.545547] alpha data-mesher[213]: time=2026-10-07T20:14:50.531Z level=INFO msg="received state sync from peer" peer=12D3KooWCYLTjRnfE7mkT3YKALPu3LU6CxFNhKtCt1YKtwA9Ldnx
container-test-run-data-mesher> alpha # [2897270.545547] alpha data-mesher[213]: time=2026-10-07T20:14:50.531Z level=INFO msg="merging remote state" peer=12D3KooWCYLTjRnfE7mkT3YKALPu3LU6CxFNhKtCt1YKtwA9Ldnx
container-test-run-data-mesher> alpha # [2897270.547505] alpha data-mesher[213]: time=2026-10-07T20:14:50.533Z level=INFO msg="received file request" peer=12D3KooWCYLTjRnfE7mkT3YKALPu3LU6CxFNhKtCt1YKtwA9Ldnx network="w/mxYnixxoBkpYcDj7p5HyX7UwN+MIX5iU6Br4MQDEo=" name=test_ns/ZSHXpiLZm7gXydOj2hiong0JlgLR52ymKrbj3Sq89zQ
container-test-run-data-mesher> alpha # [2897270.548344] alpha data-mesher[213]: time=2026-10-07T20:14:50.534Z level=INFO msg="file transfer complete" peer=12D3KooWCYLTjRnfE7mkT3YKALPu3LU6CxFNhKtCt1YKtwA9Ldnx network="w/mxYnixxoBkpYcDj7p5HyX7UwN+MIX5iU6Br4MQDEo=" name=test_ns/ZSHXpiLZm7gXydOj2hiong0JlgLR52ymKrbj3Sq89zQ
container-test-run-data-mesher> alpha # [2897271.014175] alpha data-mesher[213]: time=2026-10-07T20:14:50.999Z level=INFO msg=http_request uri=/files/test_ns/ZSHXpiLZm7gXydOj2hiong0JlgLR52ymKrbj3Sq89zQ status=403
container-test-run-data-mesher> alpha: (finished: must fail: data-mesher file update /tmp/ns_nocert --name 'test_ns/ZSHXpiLZm7gXydOj2hiong0JlgLR52ymKrbj3Sq89zQ' --url http://[::1]:7331 --key /run/secrets/per-machine/alpha/data-mesher-node-identity/identity.key --network-id /nix/store/h56kg9cirw9zl1bg0wsxcryb0lz42l90-shared-data-mesher-network_network.pub, in 0.03 seconds)
container-test-run-data-mesher> (finished: run the VM test script, in 28.59 seconds)
container-test-run-data-mesher> test script finished in 28.63s
container-test-run-data-mesher> cleanup
container-test-run-data-mesher> kill NspawnMachine (pid 52)
container-test-run-data-mesher> kill NspawnMachine (pid 54)
container-test-run-data-mesher> kill NspawnMachine (pid 56)
container-test-run-data-mesher> Container alpha terminated by signal KILL.
container-test-run-data-mesher> Container beta terminated by signal KILL.
container-test-run-data-mesher> Container gamma terminated by signal KILL.
container-test-run-data-mesher> (finished: cleanup, in 0.44 seconds)