CI run log: rad:z4ExzU1jYHivznhtDPvuTL9z5Ebit

Radicle info

Trigger message
{
  "request": "trigger",
  "version": 1,
  "event_type": "push",
  "repository": {
    "id": "rad:z4ExzU1jYHivznhtDPvuTL9z5Ebit",
    "name": "sopass",
    "description": "A command line password manager using SOP",
    "private": false,
    "default_branch": "main",
    "delegates": [
      "did:key:z6MkgEMYod7Hxfy9qCvDv5hYHkZ4ciWmLFgfvm3Wn1b2w2FV"
    ]
  },
  "pusher": {
    "id": "did:key:z6Mki2ago1X2A5UWgKpoSxyCRLLhyZMwpam4T3EKvRmFTyuy",
    "alias": "callisto.liw.fi"
  },
  "before": "3d1660ade4494dd4095f44bf1470dab10e6bf3e3",
  "after": "3d1660ade4494dd4095f44bf1470dab10e6bf3e3",
  "branch": "main",
  "commits": [
    "3d1660ade4494dd4095f44bf1470dab10e6bf3e3"
  ]
}
Ambient stdout
executor from config: /usr/bin/ambient-execute-plan
executor from PATH: /usr/bin/ambient-execute-plan
run CI for rad:z4ExzU1jYHivznhtDPvuTL9z5Ebit
======================== run log:

====================== end of run log
ERROR: CI run failed inside QEMU
Ambient stderr
<empty log>

Pre-plan VM

Structured log: all OK
  1. 0 ms: Executor starts
    • Name: ambient-execute-plan
    • Version: 0.15.0@eeab732
  2. 0 ms: Runnable plan
    steps:
    - action: mkdir
      pathname: /ci
    - action: mkdir
      pathname: /ci/artifacts
    - action: mkdir
      pathname: /ci/artifacts/debian
    - action: mkdir
      pathname: /ci/artifacts/rsync
    - action: mkdir
      pathname: /ci/secrets
    - action: mkdir
      pathname: /ci/deps
    - action: tar_extract
      archive: /dev/vdc
      directory: /ci/src
    - action: tar_extract
      archive: /dev/vdf
      directory: /ci/deps
    - action: tar_extract
      archive: /dev/vde
      directory: /ci/cache
    - action: tar_extract
      archive: /dev/vdd
      directory: /ci/artifacts
    - action: tar_extract
      archive: /dev/vdg
      directory: /ci/secrets
    - action: shell
      shell: ln -sf /ci /workspace
    - action: create_file
      filename: /root/.ssh/config
      content: "Host *\nStrictHostKeyChecking accept-new\nIdentityFile /ci/secrets/ssh_key\n                "
      overwrite: true
    - action: cargo_fetch
    - action: tar_create
      archive: /dev/vde
      directory: /ci/cache
    - action: tar_create
      archive: /dev/vdd
      directory: /ci/artifacts
    - action: tar_create
      archive: /dev/vdf
      directory: /ci/deps
    executor_drive: /dev/vdb
    source_drive: /dev/vdc
    artifact_drive: /dev/vdd
    cache_drive: /dev/vde
    deps_drive: /dev/vdf
    secrets_drive: null
    workspace_dir: /ci
    source_dir: /ci/src
    deps_dir: /ci/deps
    cache_dir: /ci/cache
    artifacts_dir: /ci/artifacts
    secrets_dir: null
    envs: {}
    
  3. 0 ms: Execute action: mkdir: /ci
    - action: mkdir
      pathname: /ci
    
  4. 1 ms: Action succeeded: mkdir: /ci
    - action: mkdir
      pathname: /ci
    
  5. 1 ms: Execute action: mkdir: /ci/artifacts
    - action: mkdir
      pathname: /ci/artifacts
    
  6. 1 ms: Action succeeded: mkdir: /ci/artifacts
    - action: mkdir
      pathname: /ci/artifacts
    
  7. 2 ms: Execute action: mkdir: /ci/artifacts/debian
    - action: mkdir
      pathname: /ci/artifacts/debian
    
  8. 2 ms: Action succeeded: mkdir: /ci/artifacts/debian
    - action: mkdir
      pathname: /ci/artifacts/debian
    
  9. 2 ms: Execute action: mkdir: /ci/artifacts/rsync
    - action: mkdir
      pathname: /ci/artifacts/rsync
    
  10. 3 ms: Action succeeded: mkdir: /ci/artifacts/rsync
    - action: mkdir
      pathname: /ci/artifacts/rsync
    
  11. 3 ms: Execute action: mkdir: /ci/secrets
    - action: mkdir
      pathname: /ci/secrets
    
  12. 3 ms: Action succeeded: mkdir: /ci/secrets
    - action: mkdir
      pathname: /ci/secrets
    
  13. 4 ms: Execute action: mkdir: /ci/deps
    - action: mkdir
      pathname: /ci/deps
    
  14. 16 ms: Action succeeded: mkdir: /ci/deps
    - action: mkdir
      pathname: /ci/deps
    
  15. 16 ms: Execute action: tar_extract
    - action: tar_extract
      archive: /dev/vdc
      directory: /ci/src
    
  16. 57 ms: Action succeeded: tar_extract
    - action: tar_extract
      archive: /dev/vdc
      directory: /ci/src
    
  17. 62 ms: Execute action: tar_extract
    - action: tar_extract
      archive: /dev/vdf
      directory: /ci/deps
    
  18. 70 ms: Action succeeded: tar_extract
    - action: tar_extract
      archive: /dev/vdf
      directory: /ci/deps
    
  19. 70 ms: Execute action: tar_extract
    - action: tar_extract
      archive: /dev/vde
      directory: /ci/cache
    
  20. 78 ms: Action succeeded: tar_extract
    - action: tar_extract
      archive: /dev/vde
      directory: /ci/cache
    
  21. 78 ms: Execute action: tar_extract
    - action: tar_extract
      archive: /dev/vdd
      directory: /ci/artifacts
    
  22. 145 ms: Action succeeded: tar_extract
    - action: tar_extract
      archive: /dev/vdd
      directory: /ci/artifacts
    
  23. 151 ms: Execute action: tar_extract
    - action: tar_extract
      archive: /dev/vdg
      directory: /ci/secrets
    
  24. 158 ms: Action succeeded: tar_extract
    - action: tar_extract
      archive: /dev/vdg
      directory: /ci/secrets
    
  25. 158 ms: Execute action: shell: ln -sf /ci /workspace
    - action: shell
      shell: ln -sf /ci /workspace
    
  26. 158 ms: Start program: bash
    • bash
    • -c
    • set -xeuo pipefail ln -sf /ci /workspace
  27. 181 ms: Program succeeded
    • Exit code: 0
    • Stdout
    • Stderr
      + ln -sf /ci /workspace
      
  28. 181 ms: Action succeeded: shell: ln -sf /ci /workspace
    - action: shell
      shell: ln -sf /ci /workspace
    
  29. 182 ms: Execute action: create_file
    - action: create_file
      filename: /root/.ssh/config
      content: "Host *\nStrictHostKeyChecking accept-new\nIdentityFile /ci/secrets/ssh_key\n                "
      overwrite: true
    
  30. 186 ms: Action succeeded: create_file
    - action: create_file
      filename: /root/.ssh/config
      content: "Host *\nStrictHostKeyChecking accept-new\nIdentityFile /ci/secrets/ssh_key\n                "
      overwrite: true
    
  31. 188 ms: Execute action: cargo_fetch
    - action: cargo_fetch
    
  32. 188 ms: Start program: cargo
    • cargo
    • --version
  33. 393 ms: Program succeeded
    • Exit code: 0
    • Stdout
      cargo 1.96.0 (30a34c682 2026-05-25)
      
    • Stderr
  34. 394 ms: Start program: cargo
    • cargo
    • clippy
    • --version
  35. 768 ms: Program succeeded
    • Exit code: 0
    • Stdout
      clippy 0.1.96 (ac68faa20c 2026-05-25)
      
    • Stderr
  36. 773 ms: Start program: rustc
    • rustc
    • --version
  37. 857 ms: Program succeeded
    • Exit code: 0
    • Stdout
      rustc 1.96.0 (ac68faa20 2026-05-25)
      
    • Stderr
  38. 862 ms: Start program: cargo
    • cargo
    • fetch
    • --locked
  39. 7462 ms: Program succeeded
    • Exit code: 0
    • Stdout
    • Stderr
          Updating crates.io index
       Downloading crates ...
        Downloaded errno v0.3.14
        Downloaded windows-link v0.2.1
        Downloaded itoa v1.0.15
        Downloaded anstream v0.6.21
        Downloaded random-number v0.1.9
        Downloaded bitflags v2.10.0
        Downloaded heck v0.5.0
        Downloaded utf8parse v0.2.2
        Downloaded env_filter v0.1.4
        Downloaded libredox v0.1.10
        Downloaded tempfile v3.23.0
        Downloaded clap_lex v0.7.6
        Downloaded cfg-if v1.0.4
        Downloaded redox_users v0.4.6
        Downloaded directories-next v2.0.0
        Downloaded equivalent v1.0.2
        Downloaded anstyle-parse v0.2.7
        Downloaded getrandom v0.3.4
        Downloaded toml_datetime v0.7.3
        Downloaded portable-atomic-util v0.2.4
        Downloaded getrandom v0.2.16
        Downloaded clap_derive v4.5.49
        Downloaded toml_parser v1.0.4
        Downloaded clap v4.5.51
        Downloaded unsafe-libyaml-norway v0.2.15
        Downloaded jiff-static v0.2.15
        Downloaded serde_norway v0.9.42
        Downloaded indexmap v2.12.0
        Downloaded wasip2 v1.0.1+wasi-0.2.4
        Downloaded memchr v2.7.6
        Downloaded clap_builder v4.5.51
        Downloaded winnow v0.7.13
        Downloaded aho-corasick v1.1.4
        Downloaded portable-atomic v1.11.1
        Downloaded zerocopy v0.8.27
        Downloaded hashbrown v0.16.0
        Downloaded rustix v1.1.2
        Downloaded syn v2.0.108
        Downloaded regex v1.12.2
        Downloaded serde_json v1.0.145
        Downloaded regex-syntax v0.8.8
        Downloaded serde v1.0.228
        Downloaded zerocopy-derive v0.8.27
        Downloaded serde_core v1.0.228
        Downloaded wit-bindgen v0.46.0
        Downloaded toml v0.9.8
        Downloaded random-number-macro-impl v0.1.8
        Downloaded env_logger v0.11.8
        Downloaded serde_derive v1.0.228
        Downloaded log v0.4.28
        Downloaded rand v0.8.5
        Downloaded r-efi v5.3.0
        Downloaded thiserror-impl v1.0.69
        Downloaded toml_writer v1.0.4
        Downloaded clingwrap v0.5.0
        Downloaded thiserror v1.0.69
        Downloaded once_cell_polyfill v1.70.2
        Downloaded anstyle v1.0.13
        Downloaded rand_core v0.6.4
        Downloaded proc-macro2 v1.0.103
        Downloaded ryu v1.0.20
        Downloaded regex-automata v0.4.13
        Downloaded ppv-lite86 v0.2.21
        Downloaded rand_chacha v0.3.1
        Downloaded anstyle-wincon v3.0.10
        Downloaded strsim v0.11.1
        Downloaded terminal_size v0.4.3
        Downloaded serde_spanned v1.0.3
        Downloaded dirs-sys-next v0.1.2
        Downloaded anstyle-query v1.1.4
        Downloaded windows-targets v0.53.5
        Downloaded colorchoice v1.0.4
        Downloaded is_terminal_polyfill v1.70.2
        Downloaded wasi v0.11.1+wasi-snapshot-preview1
        Downloaded jiff v0.2.15
        Downloaded fastrand v2.3.0
        Downloaded once_cell v1.21.3
        Downloaded proc-macro-hack v0.5.20+deprecated
        Downloaded libc v0.2.177
        Downloaded unicode-ident v1.0.22
        Downloaded windows_x86_64_gnullvm v0.53.1
        Downloaded windows_aarch64_gnullvm v0.53.1
        Downloaded quote v1.0.41
        Downloaded thiserror v2.0.17
        Downloaded windows_aarch64_msvc v0.53.1
        Downloaded windows_i686_gnullvm v0.53.1
        Downloaded windows_x86_64_msvc v0.53.1
        Downloaded windows_i686_gnu v0.53.1
        Downloaded windows_i686_msvc v0.53.1
        Downloaded windows_x86_64_gnu v0.53.1
        Downloaded random-pick v1.2.16
        Downloaded thiserror-impl v2.0.17
        Downloaded passwords v3.1.16
        Downloaded winapi v0.3.9
        Downloaded windows-sys v0.60.2
        Downloaded windows-sys v0.61.2
        Downloaded linux-raw-sys v0.11.0
        Downloaded winapi-i686-pc-windows-gnu v0.4.0
        Downloaded winapi-x86_64-pc-windows-gnu v0.4.0
      
  40. 7464 ms: Action succeeded: cargo_fetch
    - action: cargo_fetch
    
  41. 7464 ms: Execute action: tar_create
    - action: tar_create
      archive: /dev/vde
      directory: /ci/cache
    
  42. 7574 ms: Action succeeded: tar_create
    - action: tar_create
      archive: /dev/vde
      directory: /ci/cache
    
  43. 7575 ms: Execute action: tar_create
    - action: tar_create
      archive: /dev/vdd
      directory: /ci/artifacts
    
  44. 7589 ms: Action succeeded: tar_create
    - action: tar_create
      archive: /dev/vdd
      directory: /ci/artifacts
    
  45. 7597 ms: Execute action: tar_create
    - action: tar_create
      archive: /dev/vdf
      directory: /ci/deps
    
  46. 11124 ms: Action succeeded: tar_create
    - action: tar_create
      archive: /dev/vdf
      directory: /ci/deps
    
  47. 11125 ms: Plan succededThere was much rejoicing!
  48. 11125 ms: Executor ends successfullyPhew, nothing seems to have gone wrong.
Console log
BdsDxe: failed to load Boot0001 "UEFI QEMU DVD-ROM QM00005 " from PciRoot(0x0)/Pci(0x1F,0x2)/Sata(0x2,0xFFFF,0x0): Not Found
BdsDxe: loading Boot0002 "UEFI Misc Device" from PciRoot(0x0)/Pci(0x3,0x0)
BdsDxe: starting Boot0002 "UEFI Misc Device" from PciRoot(0x0)/Pci(0x3,0x0)
  Booting `Debian GNU/Linux'

Loading Linux 6.12.86+deb13-amd64 ...
Loading initial ramdisk ...
EFI stub: Loaded initrd from LINUX_EFI_INITRD_MEDIA_GUID device path
Loading, please wait...
Starting systemd-udevd version 257.13-1~deb13u1
Begin: Loading essential drivers ... done.
Begin: Running /scripts/init-premount ... done.
Begin: Mounting root file system ... Begin: Running /scripts/local-top ... done.
Begin: Running /scripts/local-premount ... done.
Begin: Will now check root file system ... fsck from util-linux 2.41
fsck: error 2 (No such file or directory) while executing fsck.ext4 for /dev/vda2
fsck exited with status code 8
done.
Warning: File system check failed but did not detect errors
done.
Begin: Running /scripts/local-bottom ... done.
Begin: Running /scripts/init-bottom ... done.

Welcome to Debian GNU/Linux 13 (trixie)!

[  OK  ] Created slice system-getty.slice - Slice /system/getty.
[  OK  ] Created slice system-modprobe.slice - Slice /system/modprobe.
[  OK  ] Created slice system-serial\x2dget…slice - Slice /system/serial-getty.
[  OK  ] Created slice user.slice - User and Session Slice.
[  OK  ] Started systemd-ask-password-conso…equests to Console Directory Watch.
[  OK  ] Started systemd-ask-password-wall.…d Requests to Wall Directory Watch.
[  OK  ] Set up automount proc-sys-fs-binfm…ormats File System Automount Point.
         Expecting device dev-ttyS0.device - /dev/ttyS0...
[  OK  ] Reached target paths.target - Path Units.
[  OK  ] Reached target remote-fs.target - Remote File Systems.
[  OK  ] Reached target slices.target - Slice Units.
[  OK  ] Reached target swap.target - Swaps.
[  OK  ] Listening on systemd-creds.socket - Credential Encryption/Decryption.
[  OK  ] Listening on systemd-initctl.socke…- initctl Compatibility Named Pipe.
[  OK  ] Listening on systemd-journald-dev-…socket - Journal Socket (/dev/log).
[  OK  ] Listening on systemd-journald.socket - Journal Sockets.
[  OK  ] Listening on systemd-networkd.socket - Network Service Netlink Socket.
[  OK  ] Listening on systemd-udevd-control.socket - udev Control Socket.
[  OK  ] Listening on systemd-udevd-kernel.socket - udev Kernel Socket.
         Mounting dev-hugepages.mount - Huge Pages File System...
         Mounting dev-mqueue.mount - POSIX Message Queue File System...
         Mounting run-lock.mount - Legacy Locks Directory /run/lock...
         Mounting sys-kernel-debug.mount - Kernel Debug File System...
         Mounting sys-kernel-tracing.mount - Kernel Trace File System...
         Mounting tmp.mount - Temporary Directory /tmp...
         Starting kmod-static-nodes.service…eate List of Static Device Nodes...
         Starting modprobe@configfs.service - Load Kernel Module configfs...
         Starting modprobe@drm.service - Load Kernel Module drm...
         Starting modprobe@efi_pstore.servi… - Load Kernel Module efi_pstore...
         Starting modprobe@fuse.service - Load Kernel Module fuse...
         Starting systemd-journald.service - Journal Service...
         Starting systemd-modules-load.service - Load Kernel Modules...
         Starting systemd-network-generator…k Units from Kernel Command Line...
         Starting systemd-remount-fs.servic…unt Root and Kernel File Systems...
         Starting systemd-udev-load-credent…Load udev Rules from Credentials...
         Starting systemd-udev-trigger.service - Coldplug All udev Devices...
[  OK  ] Mounted dev-hugepages.mount - Huge Pages File System.
[  OK  ] Mounted dev-mqueue.mount - POSIX Message Queue File System.
[  OK  ] Mounted run-lock.mount - Legacy Locks Directory /run/lock.
[  OK  ] Mounted sys-kernel-debug.mount - Kernel Debug File System.
[  OK  ] Mounted sys-kernel-tracing.mount - Kernel Trace File System.
[  OK  ] Mounted tmp.mount - Temporary Directory /tmp.
[  OK  ] Finished kmod-static-nodes.service…Create List of Static Device Nodes.
[  OK  ] Finished modprobe@configfs.service - Load Kernel Module configfs.
[  OK  ] Finished modprobe@drm.service - Load Kernel Module drm.
[  OK  ] Finished modprobe@efi_pstore.service - Load Kernel Module efi_pstore.
[  OK  ] Finished modprobe@fuse.service - Load Kernel Module fuse.
[  OK  ] Finished systemd-modules-load.service - Load Kernel Modules.
[  OK  ] Finished systemd-network-generator…ork Units from Kernel Command Line.
[  OK  ] Finished systemd-remount-fs.servic…mount Root and Kernel File Systems.
[  OK  ] Finished systemd-udev-load-credent…- Load udev Rules from Credentials.
[  OK  ] Reached target network-pre.target - Preparation for Network.
         Mounting sys-fs-fuse-connections.mount - FUSE Control File System...
         Mounting sys-kernel-config.mount - Kernel Configuration File System...
         Starting systemd-random-seed.service - Load/Save OS Random Seed...
         Starting systemd-sysctl.service - Apply Kernel Variables...
         Starting systemd-tmpfiles-setup-de… Device Nodes in /dev gracefully...
[  OK  ] Started systemd-journald.service - Journal Service.
[  OK  ] Mounted sys-fs-fuse-connections.mount - FUSE Control File System.
[  OK  ] Mounted sys-kernel-config.mount - Kernel Configuration File System.
         Starting systemd-journal-flush.ser…sh Journal to Persistent Storage...
[  OK  ] Finished systemd-udev-trigger.service - Coldplug All udev Devices.
[  OK  ] Finished systemd-sysctl.service - Apply Kernel Variables.
[  OK  ] Finished systemd-random-seed.service - Load/Save OS Random Seed.
[  OK  ] Finished systemd-tmpfiles-setup-de…ic Device Nodes in /dev gracefully.
         Starting systemd-sysusers.service - Create System Users...
[  OK  ] Finished systemd-sysusers.service - Create System Users.
         Starting systemd-resolved.service - Network Name Resolution...
         Starting systemd-tmpfiles-setup-de…eate Static Device Nodes in /dev...
[  OK  ] Finished systemd-tmpfiles-setup-de…Create Static Device Nodes in /dev.
[  OK  ] Finished systemd-journal-flush.ser…lush Journal to Persistent Storage.
[  OK  ] Reached target local-fs-pre.target…Preparation for Local File Systems.
[  OK  ] Set up automount efi.automount - EFI System Partition Automount.
[  OK  ] Reached target local-fs.target - Local File Systems.
[  OK  ] Listening on systemd-sysext.socket… System Extension Image Management.
         Starting systemd-binfmt.service - Set Up Additional Binary Formats...
         Starting systemd-tmpfiles-setup.se…ate System Files and Directories...
         Starting systemd-udevd.service - R…ager for Device Events and Files...
[  OK  ] Finished systemd-tmpfiles-setup.se…reate System Files and Directories.
         Starting ldconfig.service - Rebuild Dynamic Linker Cache...
         Starting systemd-journal-catalog-u…ervice - Rebuild Journal Catalog...
[  OK  ] Started systemd-resolved.service - Network Name Resolution.
[  OK  ] Reached target nss-lookup.target - Host and Network Name Lookups.
[  OK  ] Started systemd-udevd.service - Ru…anager for Device Events and Files.
         Starting systemd-networkd.service - Network Configuration...
[  OK  ] Finished systemd-journal-catalog-u….service - Rebuild Journal Catalog.
[  OK  ] Found device dev-ttyS0.device - /dev/ttyS0.
         Mounting proc-sys-fs-binfmt_misc.m…cutable File Formats File System...
[  OK  ] Mounted proc-sys-fs-binfmt_misc.mo…xecutable File Formats File System.
[  OK  ] Finished systemd-binfmt.service - Set Up Additional Binary Formats.
[  OK  ] Finished ldconfig.service - Rebuild Dynamic Linker Cache.
         Starting systemd-update-done.service - Update is Completed...
[  OK  ] Finished systemd-update-done.service - Update is Completed.
[  OK  ] Reached target sysinit.target - System Initialization.
[  OK  ] Started apt-daily.timer - Daily apt download activities.
[  OK  ] Started apt-daily-upgrade.timer - …y apt upgrade and clean activities.
[  OK  ] Started dpkg-db-backup.timer - Daily dpkg database backup timer.
[  OK  ] Started fstrim.timer - Discard unused filesystem blocks once a week.
[  OK  ] Started man-db.timer - Daily man-db regeneration.
[  OK  ] Started systemd-tmpfiles-clean.tim…y Cleanup of Temporary Directories.
[  OK  ] Reached target timers.target - Timer Units.
[  OK  ] Listening on dbus.socket - D-Bus System Message Bus Socket.
[  OK  ] Listening on sshd-unix-local.socke…temd-ssh-generator, AF_UNIX Local).
[  OK  ] Listening on systemd-hostnamed.socket - Hostname Service Socket.
[  OK  ] Reached target sockets.target - Socket Units.
[  OK  ] Reached target basic.target - Basic System.
         Starting ambient.service - Run build job for Ambient CI...
         Starting dbus.service - D-Bus System Message Bus...
         Starting grub-common.service - Record successful boot for GRUB...
         Starting systemd-logind.service - User Login Management...
[  OK  ] Started dbus.service - D-Bus System Message Bus.
[  OK  ] Listening on systemd-rfkill.socket…ll Switch Status /dev/rfkill Watch.
[  OK  ] Started systemd-logind.service - User Login Management.
[  OK  ] Finished grub-common.service - Record successful boot for GRUB.
[  OK  ] Started systemd-networkd.service - Network Configuration.
[  OK  ] Reached target network.target - Network.
         Starting ssh.service - OpenBSD Secure Shell server...
         Starting systemd-networkd-persiste…tent Storage in systemd-networkd...
         Starting systemd-user-sessions.service - Permit User Sessions...
[  OK  ] Finished systemd-networkd-persiste…istent Storage in systemd-networkd.
[  OK  ] Finished systemd-user-sessions.service - Permit User Sessions.
[  OK  ] Started getty@tty1.service - Getty on tty1.
[  OK  ] Started serial-getty@ttyS0.service - Serial Getty on ttyS0.
[  OK  ] Reached target getty.target - Login Prompts.
[  OK  ] Started ssh.service - OpenBSD Secure Shell server.

Debian GNU/Linux 13 ambient-dev ttyS0

ambient-dev login: [  OK  ] Stopped ambient.service - Run build job for Ambient CI.
[  OK  ] Removed slice system-modprobe.slice - Slice /system/modprobe.
[  OK  ] Stopped target getty.target - Login Prompts.
[  OK  ] Stopped target nss-lookup.target - Host and Network Name Lookups.
[  OK  ] Stopped target timers.target - Timer Units.
[  OK  ] Stopped apt-daily-upgrade.timer - …y apt upgrade and clean activities.
[  OK  ] Stopped apt-daily.timer - Daily apt download activities.
[  OK  ] Stopped dpkg-db-backup.timer - Daily dpkg database backup timer.
[  OK  ] Stopped fstrim.timer - Discard unused filesystem blocks once a week.
[  OK  ] Stopped man-db.timer - Daily man-db regeneration.
[  OK  ] Stopped systemd-tmpfiles-clean.tim…y Cleanup of Temporary Directories.
[  OK  ] Closed systemd-rfkill.socket -         Stopping serial-getty@ttyS0.service - Serial Getty on ttyS0...
         Stopping ssh.service - OpenBSD Secure Shell server...
         Stopping systemd-logind.service - User Login Management...
         Stopping systemd-networkd-persiste…tent Storage in systemd-networkd...
         Stopping systemd-random-seed.service - Load/Save OS Random Seed...
[  OK  ] Stopped systemd-udev-load-credenti…- Load udev Rules from Credentials.
[  OK  ] Stopped getty@tty1.service - Getty on tty1.
[  OK  ] Stopped dbus.service - D-Bus System Message Bus.
[  OK  ] Stopped serial-getty@ttyS0.service - Serial Getty on ttyS0.
[  OK  ] Stopped ssh.service - OpenBSD Secure Shell server.
[  OK  ] Stopped systemd-networkd-persisten…istent Storage in systemd-networkd.
[  OK  ] Stopped systemd-random-seed.service - Load/Save OS Random Seed.
[  OK  ] Stopped systemd-logind.service - User Login Management.
[  OK  ] Removed slice system-getty.slice - Slice /system/getty.
[  OK  ] Removed slice system-serial\x2dget…slice - Slice /system/serial-getty.
         Stopping systemd-user-sessions.service - Permit User Sessions...
[  OK  ] Stopped systemd-user-sessions.service - Permit User Sessions.
[  OK  ] Stopped target basic.target - Basic System.
[  OK  ] Stopped target network.target - Network.
[  OK  ] Stopped target paths.target - Path Units.
[  OK  ] Stopped systemd-ask-password-conso…equests to Console Directory Watch.
[  OK  ] Stopped systemd-ask-password-wall.…d Requests to Wall Directory Watch.
[  OK  ] Stopped target remote-fs.target - Remote File Systems.
[  OK  ] Stopped target slices.target - Slice Units.
[  OK  ] Removed slice user.slice - User and Session Slice.
[  OK  ] Stopped target sockets.target - Socket Units.
[  OK  ] Closed dbus.socket - D-Bus System Message Bus Socket.
[  OK  ] Closed sshd-unix-local.socket - Op…temd-ssh-generator, AF_UNIX Local).
[  OK  ] Closed systemd-hostnamed.socket - Hostname Service Socket.
[  OK  ] Stopped target sysinit.target - System Initialization.
         Stopping systemd-binfmt.service - Set Up Additional Binary Formats...
         Stopping systemd-networkd.service - Network Configuration...
         Stopping systemd-resolved.service - Network Name Resolution...
[  OK  ] Stopped systemd-update-done.service - Update is Completed.
[  OK  ] Stopped ldconfig.service - Rebuild Dynamic Linker Cache.
[  OK  ] Stopped systemd-journal-catalog-up….service - Rebuild Journal Catalog.
[  OK  ] Stopped systemd-tmpfiles-setup.ser…reate System Files and Directories.
[  OK  ] Stopped systemd-networkd.service - Network Configuration.
[  OK  ] Stopped target network-pre.target - Preparation for Network.
[  OK  ] Closed systemd-networkd.socket - Network Service Netlink Socket.
[  OK  ] Stopped systemd-network-generator.…ork Units from Kernel Command Line.
[  OK  ] Stopped systemd-resolved.service - Network Name Resolution.
[  OK  ] Stopped systemd-sysctl.service - Apply Kernel Variables.
[  OK  ] Stopped systemd-modules-load.service - Load Kernel Modules.
[  OK  ] Stopped systemd-binfmt.service - Set Up Additional Binary Formats.
[  OK  ] Unset automount proc-sys-fs-binfmt…ormats File System Automount Point.
[  OK  ] Stopped target local-fs.target - Local File Systems.
[  OK  ] Unset automount efi.automount - EFI System Partition Automount.
[  OK  ] Stopped target local-fs-pre.target…Preparation for Local File Systems.
         Unmounting run-lock.mount - Legacy Locks Directory /run/lock...
         Unmounting tmp.mount - Temporary Directory /tmp...
[  OK  ] Stopped systemd-tmpfiles-setup-dev…Create Static Device Nodes in /dev.
[  OK  ] Stopped systemd-sysusers.service - Create System Users.
[  OK  ] Stopped systemd-remount-fs.service…mount Root and Kernel File Systems.
[  OK  ] Stopped systemd-tmpfiles-setup-dev…ic Device Nodes in /dev gracefully.
[  OK  ] Unmounted run-lock.mount - Legacy Locks Directory /run/lock.
[  OK  ] Unmounted tmp.mount - Temporary Directory /tmp.
[  OK  ] Stopped target swap.target - Swaps.
[  OK  ] Reached target shutdown.target - System Shutdown.
[  OK  ] Reached target umount.target - Unmount All Filesystems.
[  OK  ] Reached target final.target - Late Shutdown Services.
[  OK  ] Finished systemd-poweroff.service - System Power Off.
[  OK  ] Reached target poweroff.target - System Power Off.
[   22.928851] reboot: Power down
Raw run log
BdsDxe: failed to load Boot0001 "UEFI QEMU DVD-ROM QM00005 " from PciRoot(0x0)/Pci(0x1F,0x2)/Sata(0x2,0xFFFF,0x0): Not Found
BdsDxe: loading Boot0002 "UEFI Misc Device" from PciRoot(0x0)/Pci(0x3,0x0)
BdsDxe: starting Boot0002 "UEFI Misc Device" from PciRoot(0x0)/Pci(0x3,0x0)
EFI stub: Loaded initrd from LINUX_EFI_INITRD_MEDIA_GUID device path
INFO: Block devices
NAME   MAJ:MIN RM   SIZE RO TYPE MOUNTPOINTS
vda    254:0    0   100G  0 disk 
├─vda1 254:1    0   953M  0 part 
└─vda2 254:2    0  99.1G  0 part /
vdb    254:16   0   5.3M  1 disk 
vdc    254:32   0   1.4M  1 disk 
vdd    254:48   0 953.7M  0 disk 
vde    254:64   0  27.9G  0 disk 
vdf    254:80   0   100G  0 disk 
vdg    254:96   0    10K  1 disk 
INFO: Extracting tar archive from /dev/vdb
drwxr-xr-x _rad/_rad         0 2026-06-30 14:56 ./
-rw-r--r-- _rad/_rad      1294 2026-06-30 14:56 ./plan.yaml
-rwxr-xr-x _rad/_rad   5517632 2026-06-30 14:56 ./run-ci
INFO: Extracted files:
        6      0 drwxr-xr-x   2 1000     1000           80 Jun 30 14:56 .
       10   5392 -rwxr-xr-x   1 1000     1000      5517632 Jun 30 14:56 ./run-ci
        9      4 -rw-r--r--   1 1000     1000         1294 Jun 30 14:56 ./plan.yaml
INFO: Running run-ci from /dev/vdb
================================ BEGIN ================================
{"type":"executor_starts","name":"ambient-execute-plan","version":"0.15.0@eeab732","timestamp":{"secs_since_epoch":1782831420,"nanos_since_epoch":124545329},"log_source":"Plan"}
{"type":"runnable_plan","steps":[{"action":"mkdir","pathname":"/ci"},{"action":"mkdir","pathname":"/ci/artifacts"},{"action":"mkdir","pathname":"/ci/artifacts/debian"},{"action":"mkdir","pathname":"/ci/artifacts/rsync"},{"action":"mkdir","pathname":"/ci/secrets"},{"action":"mkdir","pathname":"/ci/deps"},{"action":"tar_extract","archive":"/dev/vdc","directory":"/ci/src"},{"action":"tar_extract","archive":"/dev/vdf","directory":"/ci/deps"},{"action":"tar_extract","archive":"/dev/vde","directory":"/ci/cache"},{"action":"tar_extract","archive":"/dev/vdd","directory":"/ci/artifacts"},{"action":"tar_extract","archive":"/dev/vdg","directory":"/ci/secrets"},{"action":"shell","shell":"ln -sf /ci /workspace"},{"action":"create_file","filename":"/root/.ssh/config","content":"Host *\nStrictHostKeyChecking accept-new\nIdentityFile /ci/secrets/ssh_key\n                ","overwrite":true},{"action":"cargo_fetch"},{"action":"tar_create","archive":"/dev/vde","directory":"/ci/cache"},{"action":"tar_create","archive":"/dev/vdd","directory":"/ci/artifacts"},{"action":"tar_create","archive":"/dev/vdf","directory":"/ci/deps"}],"executor_drive":"/dev/vdb","source_drive":"/dev/vdc","artifact_drive":"/dev/vdd","cache_drive":"/dev/vde","deps_drive":"/dev/vdf","secrets_drive":null,"workspace_dir":"/ci","source_dir":"/ci/src","deps_dir":"/ci/deps","cache_dir":"/ci/cache","artifacts_dir":"/ci/artifacts","secrets_dir":null,"envs":{},"timestamp":{"secs_since_epoch":1782831420,"nanos_since_epoch":125081266},"log_source":"Plan"}
{"type":"execute_action","action":"mkdir","pathname":"/ci","timestamp":{"secs_since_epoch":1782831420,"nanos_since_epoch":125186221},"log_source":"Plan"}
{"type":"action_succeeded","action":"mkdir","pathname":"/ci","timestamp":{"secs_since_epoch":1782831420,"nanos_since_epoch":125791158},"log_source":"Plan"}
{"type":"execute_action","action":"mkdir","pathname":"/ci/artifacts","timestamp":{"secs_since_epoch":1782831420,"nanos_since_epoch":125961669},"log_source":"Plan"}
{"type":"action_succeeded","action":"mkdir","pathname":"/ci/artifacts","timestamp":{"secs_since_epoch":1782831420,"nanos_since_epoch":126342843},"log_source":"Plan"}
{"type":"execute_action","action":"mkdir","pathname":"/ci/artifacts/debian","timestamp":{"secs_since_epoch":1782831420,"nanos_since_epoch":126560410},"log_source":"Plan"}
{"type":"action_succeeded","action":"mkdir","pathname":"/ci/artifacts/debian","timestamp":{"secs_since_epoch":1782831420,"nanos_since_epoch":127268679},"log_source":"Plan"}
{"type":"execute_action","action":"mkdir","pathname":"/ci/artifacts/rsync","timestamp":{"secs_since_epoch":1782831420,"nanos_since_epoch":127481242},"log_source":"Plan"}
{"type":"action_succeeded","action":"mkdir","pathname":"/ci/artifacts/rsync","timestamp":{"secs_since_epoch":1782831420,"nanos_since_epoch":127854063},"log_source":"Plan"}
{"type":"execute_action","action":"mkdir","pathname":"/ci/secrets","timestamp":{"secs_since_epoch":1782831420,"nanos_since_epoch":128084809},"log_source":"Plan"}
{"type":"action_succeeded","action":"mkdir","pathname":"/ci/secrets","timestamp":{"secs_since_epoch":1782831420,"nanos_since_epoch":128474821},"log_source":"Plan"}
{"type":"execute_action","action":"mkdir","pathname":"/ci/deps","timestamp":{"secs_since_epoch":1782831420,"nanos_since_epoch":128698280},"log_source":"Plan"}
{"type":"action_succeeded","action":"mkdir","pathname":"/ci/deps","timestamp":{"secs_since_epoch":1782831420,"nanos_since_epoch":141347634},"log_source":"Plan"}
{"type":"execute_action","action":"tar_extract","archive":"/dev/vdc","directory":"/ci/src","timestamp":{"secs_since_epoch":1782831420,"nanos_since_epoch":141491352},"log_source":"Plan"}
{"type":"action_succeeded","action":"tar_extract","archive":"/dev/vdc","directory":"/ci/src","timestamp":{"secs_since_epoch":1782831420,"nanos_since_epoch":181642426},"log_source":"Plan"}
{"type":"execute_action","action":"tar_extract","archive":"/dev/vdf","directory":"/ci/deps","timestamp":{"secs_since_epoch":1782831420,"nanos_since_epoch":187103357},"log_source":"Plan"}
{"type":"action_succeeded","action":"tar_extract","archive":"/dev/vdf","directory":"/ci/deps","timestamp":{"secs_since_epoch":1782831420,"nanos_since_epoch":194949283},"log_source":"Plan"}
{"type":"execute_action","action":"tar_extract","archive":"/dev/vde","directory":"/ci/cache","timestamp":{"secs_since_epoch":1782831420,"nanos_since_epoch":195047339},"log_source":"Plan"}
{"type":"action_succeeded","action":"tar_extract","archive":"/dev/vde","directory":"/ci/cache","timestamp":{"secs_since_epoch":1782831420,"nanos_since_epoch":203218664},"log_source":"Plan"}
{"type":"execute_action","action":"tar_extract","archive":"/dev/vdd","directory":"/ci/artifacts","timestamp":{"secs_since_epoch":1782831420,"nanos_since_epoch":203462662},"log_source":"Plan"}
{"type":"action_succeeded","action":"tar_extract","archive":"/dev/vdd","directory":"/ci/artifacts","timestamp":{"secs_since_epoch":1782831420,"nanos_since_epoch":269811250},"log_source":"Plan"}
{"type":"execute_action","action":"tar_extract","archive":"/dev/vdg","directory":"/ci/secrets","timestamp":{"secs_since_epoch":1782831420,"nanos_since_epoch":276256195},"log_source":"Plan"}
{"type":"action_succeeded","action":"tar_extract","archive":"/dev/vdg","directory":"/ci/secrets","timestamp":{"secs_since_epoch":1782831420,"nanos_since_epoch":282774954},"log_source":"Plan"}
{"type":"execute_action","action":"shell","shell":"ln -sf /ci /workspace","timestamp":{"secs_since_epoch":1782831420,"nanos_since_epoch":282982415},"log_source":"Plan"}
{"type":"start_program","argv":[{"Unix":[98,97,115,104]},{"Unix":[45,99]},{"Unix":[115,101,116,32,45,120,101,117,111,32,112,105,112,101,102,97,105,108,10,108,110,32,45,115,102,32,47,99,105,32,47,119,111,114,107,115,112,97,99,101,10]}],"timestamp":{"secs_since_epoch":1782831420,"nanos_since_epoch":283323991},"log_source":"Plan"}
{"type":"program_succeeded","exit_code":0,"stdout":"","stderr":"+ ln -sf /ci /workspace\n","timestamp":{"secs_since_epoch":1782831420,"nanos_since_epoch":306030417},"log_source":"Plan"}
{"type":"action_succeeded","action":"shell","shell":"ln -sf /ci /workspace","timestamp":{"secs_since_epoch":1782831420,"nanos_since_epoch":306336982},"log_source":"Plan"}
{"type":"execute_action","action":"create_file","filename":"/root/.ssh/config","content":"Host *\nStrictHostKeyChecking accept-new\nIdentityFile /ci/secrets/ssh_key\n                ","overwrite":true,"timestamp":{"secs_since_epoch":1782831420,"nanos_since_epoch":306656857},"log_source":"Plan"}
{"type":"action_succeeded","action":"create_file","filename":"/root/.ssh/config","content":"Host *\nStrictHostKeyChecking accept-new\nIdentityFile /ci/secrets/ssh_key\n                ","overwrite":true,"timestamp":{"secs_since_epoch":1782831420,"nanos_since_epoch":310926510},"log_source":"Plan"}
{"type":"execute_action","action":"cargo_fetch","timestamp":{"secs_since_epoch":1782831420,"nanos_since_epoch":313126213},"log_source":"Plan"}
{"type":"start_program","argv":[{"Unix":[99,97,114,103,111]},{"Unix":[45,45,118,101,114,115,105,111,110]}],"timestamp":{"secs_since_epoch":1782831420,"nanos_since_epoch":313506031},"log_source":"Plan"}
{"type":"program_succeeded","exit_code":0,"stdout":"cargo 1.96.0 (30a34c682 2026-05-25)\n","stderr":"","timestamp":{"secs_since_epoch":1782831420,"nanos_since_epoch":518153202},"log_source":"Plan"}
{"type":"start_program","argv":[{"Unix":[99,97,114,103,111]},{"Unix":[99,108,105,112,112,121]},{"Unix":[45,45,118,101,114,115,105,111,110]}],"timestamp":{"secs_since_epoch":1782831420,"nanos_since_epoch":519312579},"log_source":"Plan"}
{"type":"program_succeeded","exit_code":0,"stdout":"clippy 0.1.96 (ac68faa20c 2026-05-25)\n","stderr":"","timestamp":{"secs_since_epoch":1782831420,"nanos_since_epoch":893090982},"log_source":"Plan"}
{"type":"start_program","argv":[{"Unix":[114,117,115,116,99]},{"Unix":[45,45,118,101,114,115,105,111,110]}],"timestamp":{"secs_since_epoch":1782831420,"nanos_since_epoch":898092805},"log_source":"Plan"}
{"type":"program_succeeded","exit_code":0,"stdout":"rustc 1.96.0 (ac68faa20 2026-05-25)\n","stderr":"","timestamp":{"secs_since_epoch":1782831420,"nanos_since_epoch":981979481},"log_source":"Plan"}
copying relevant files to /tmp/.tmpBYdGjs
{"type":"start_program","argv":[{"Unix":[99,97,114,103,111]},{"Unix":[102,101,116,99,104]},{"Unix":[45,45,108,111,99,107,101,100]}],"timestamp":{"secs_since_epoch":1782831420,"nanos_since_epoch":986626996},"log_source":"Plan"}
{"type":"program_succeeded","exit_code":0,"stdout":"","stderr":"    Updating crates.io index\n Downloading crates ...\n  Downloaded errno v0.3.14\n  Downloaded windows-link v0.2.1\n  Downloaded itoa v1.0.15\n  Downloaded anstream v0.6.21\n  Downloaded random-number v0.1.9\n  Downloaded bitflags v2.10.0\n  Downloaded heck v0.5.0\n  Downloaded utf8parse v0.2.2\n  Downloaded env_filter v0.1.4\n  Downloaded libredox v0.1.10\n  Downloaded tempfile v3.23.0\n  Downloaded clap_lex v0.7.6\n  Downloaded cfg-if v1.0.4\n  Downloaded redox_users v0.4.6\n  Downloaded directories-next v2.0.0\n  Downloaded equivalent v1.0.2\n  Downloaded anstyle-parse v0.2.7\n  Downloaded getrandom v0.3.4\n  Downloaded toml_datetime v0.7.3\n  Downloaded portable-atomic-util v0.2.4\n  Downloaded getrandom v0.2.16\n  Downloaded clap_derive v4.5.49\n  Downloaded toml_parser v1.0.4\n  Downloaded clap v4.5.51\n  Downloaded unsafe-libyaml-norway v0.2.15\n  Downloaded jiff-static v0.2.15\n  Downloaded serde_norway v0.9.42\n  Downloaded indexmap v2.12.0\n  Downloaded wasip2 v1.0.1+wasi-0.2.4\n  Downloaded memchr v2.7.6\n  Downloaded clap_builder v4.5.51\n  Downloaded winnow v0.7.13\n  Downloaded aho-corasick v1.1.4\n  Downloaded portable-atomic v1.11.1\n  Downloaded zerocopy v0.8.27\n  Downloaded hashbrown v0.16.0\n  Downloaded rustix v1.1.2\n  Downloaded syn v2.0.108\n  Downloaded regex v1.12.2\n  Downloaded serde_json v1.0.145\n  Downloaded regex-syntax v0.8.8\n  Downloaded serde v1.0.228\n  Downloaded zerocopy-derive v0.8.27\n  Downloaded serde_core v1.0.228\n  Downloaded wit-bindgen v0.46.0\n  Downloaded toml v0.9.8\n  Downloaded random-number-macro-impl v0.1.8\n  Downloaded env_logger v0.11.8\n  Downloaded serde_derive v1.0.228\n  Downloaded log v0.4.28\n  Downloaded rand v0.8.5\n  Downloaded r-efi v5.3.0\n  Downloaded thiserror-impl v1.0.69\n  Downloaded toml_writer v1.0.4\n  Downloaded clingwrap v0.5.0\n  Downloaded thiserror v1.0.69\n  Downloaded once_cell_polyfill v1.70.2\n  Downloaded anstyle v1.0.13\n  Downloaded rand_core v0.6.4\n  Downloaded proc-macro2 v1.0.103\n  Downloaded ryu v1.0.20\n  Downloaded regex-automata v0.4.13\n  Downloaded ppv-lite86 v0.2.21\n  Downloaded rand_chacha v0.3.1\n  Downloaded anstyle-wincon v3.0.10\n  Downloaded strsim v0.11.1\n  Downloaded terminal_size v0.4.3\n  Downloaded serde_spanned v1.0.3\n  Downloaded dirs-sys-next v0.1.2\n  Downloaded anstyle-query v1.1.4\n  Downloaded windows-targets v0.53.5\n  Downloaded colorchoice v1.0.4\n  Downloaded is_terminal_polyfill v1.70.2\n  Downloaded wasi v0.11.1+wasi-snapshot-preview1\n  Downloaded jiff v0.2.15\n  Downloaded fastrand v2.3.0\n  Downloaded once_cell v1.21.3\n  Downloaded proc-macro-hack v0.5.20+deprecated\n  Downloaded libc v0.2.177\n  Downloaded unicode-ident v1.0.22\n  Downloaded windows_x86_64_gnullvm v0.53.1\n  Downloaded windows_aarch64_gnullvm v0.53.1\n  Downloaded quote v1.0.41\n  Downloaded thiserror v2.0.17\n  Downloaded windows_aarch64_msvc v0.53.1\n  Downloaded windows_i686_gnullvm v0.53.1\n  Downloaded windows_x86_64_msvc v0.53.1\n  Downloaded windows_i686_gnu v0.53.1\n  Downloaded windows_i686_msvc v0.53.1\n  Downloaded windows_x86_64_gnu v0.53.1\n  Downloaded random-pick v1.2.16\n  Downloaded thiserror-impl v2.0.17\n  Downloaded passwords v3.1.16\n  Downloaded winapi v0.3.9\n  Downloaded windows-sys v0.60.2\n  Downloaded windows-sys v0.61.2\n  Downloaded linux-raw-sys v0.11.0\n  Downloaded winapi-i686-pc-windows-gnu v0.4.0\n  Downloaded winapi-x86_64-pc-windows-gnu v0.4.0\n","timestamp":{"secs_since_epoch":1782831427,"nanos_since_epoch":587045548},"log_source":"Plan"}
{"type":"action_succeeded","action":"cargo_fetch","timestamp":{"secs_since_epoch":1782831427,"nanos_since_epoch":588833980},"log_source":"Plan"}
{"type":"execute_action","action":"tar_create","archive":"/dev/vde","directory":"/ci/cache","timestamp":{"secs_since_epoch":1782831427,"nanos_since_epoch":588883836},"log_source":"Plan"}
{"type":"action_succeeded","action":"tar_create","archive":"/dev/vde","directory":"/ci/cache","timestamp":{"secs_since_epoch":1782831427,"nanos_since_epoch":699276883},"log_source":"Plan"}
{"type":"execute_action","action":"tar_create","archive":"/dev/vdd","directory":"/ci/artifacts","timestamp":{"secs_since_epoch":1782831427,"nanos_since_epoch":699998538},"log_source":"Plan"}
{"type":"action_succeeded","action":"tar_create","archive":"/dev/vdd","directory":"/ci/artifacts","timestamp":{"secs_since_epoch":1782831427,"nanos_since_epoch":713614642},"log_source":"Plan"}
{"type":"execute_action","action":"tar_create","archive":"/dev/vdf","directory":"/ci/deps","timestamp":{"secs_since_epoch":1782831427,"nanos_since_epoch":721949856},"log_source":"Plan"}
{"type":"action_succeeded","action":"tar_create","archive":"/dev/vdf","directory":"/ci/deps","timestamp":{"secs_since_epoch":1782831431,"nanos_since_epoch":249095515},"log_source":"Plan"}
{"type":"plan_succeeded","timestamp":{"secs_since_epoch":1782831431,"nanos_since_epoch":249946690},"log_source":"Plan"}
{"type":"executor_ends_successfully","timestamp":{"secs_since_epoch":1782831431,"nanos_since_epoch":250281556},"log_source":"Plan"}
EXIT CODE: 0

Plan VM

Structured log: successful actions
  1. 0 ms: Executor starts
    • Name: ambient-execute-plan
    • Version: 0.15.0@eeab732
  2. 2 ms: Runnable plan
    steps:
    - action: mkdir
      pathname: /ci
    - action: mkdir
      pathname: /ci/artifacts
    - action: mkdir
      pathname: /ci/artifacts/debian
    - action: mkdir
      pathname: /ci/artifacts/rsync
    - action: mkdir
      pathname: /ci/secrets
    - action: mkdir
      pathname: /ci/deps
    - action: tar_extract
      archive: /dev/vdc
      directory: /ci/src
    - action: tar_extract
      archive: /dev/vdf
      directory: /ci/deps
    - action: tar_extract
      archive: /dev/vde
      directory: /ci/cache
    - action: tar_extract
      archive: /dev/vdd
      directory: /ci/artifacts
    - action: tar_extract
      archive: /dev/vdg
      directory: /ci/secrets
    - action: shell
      shell: ln -sf /ci /workspace
    - action: create_file
      filename: /root/.ssh/config
      content: "Host *\nStrictHostKeyChecking accept-new\nIdentityFile /ci/secrets/ssh_key\n                "
      overwrite: true
    - action: cargo_fmt
    - action: cargo_clippy
    - action: cargo_build
    - action: shell
      shell: |
        make sopass.html userguide.html
        mkdir /ci/artifacts/rsync
        mv sopass.html userguide.html /ci/artifacts/rsync
    - action: shell
      shell: |
        make OFFLINE="--offline --locked"
        git clean -fdx
    - action: custom
      name: dch
      args:
        debfullname: Lars Wirzenius
        debemail: liw@liw.fi
    - action: deb
      packages: debian
    - action: tar_create
      archive: /dev/vde
      directory: /ci/cache
    - action: tar_create
      archive: /dev/vdd
      directory: /ci/artifacts
    executor_drive: /dev/vdb
    source_drive: /dev/vdc
    artifact_drive: /dev/vdd
    cache_drive: /dev/vde
    deps_drive: /dev/vdf
    secrets_drive: null
    workspace_dir: /ci
    source_dir: /ci/src
    deps_dir: /ci/deps
    cache_dir: /ci/cache
    artifacts_dir: /ci/artifacts
    secrets_dir: null
    envs: {}
    
  3. 3 ms: Execute action: mkdir: /ci
    - action: mkdir
      pathname: /ci
    
  4. 4 ms: Action succeeded: mkdir: /ci
    - action: mkdir
      pathname: /ci
    
  5. 7 ms: Execute action: mkdir: /ci/artifacts
    - action: mkdir
      pathname: /ci/artifacts
    
  6. 7 ms: Action succeeded: mkdir: /ci/artifacts
    - action: mkdir
      pathname: /ci/artifacts
    
  7. 7 ms: Execute action: mkdir: /ci/artifacts/debian
    - action: mkdir
      pathname: /ci/artifacts/debian
    
  8. 10 ms: Action succeeded: mkdir: /ci/artifacts/debian
    - action: mkdir
      pathname: /ci/artifacts/debian
    
  9. 10 ms: Execute action: mkdir: /ci/artifacts/rsync
    - action: mkdir
      pathname: /ci/artifacts/rsync
    
  10. 11 ms: Action succeeded: mkdir: /ci/artifacts/rsync
    - action: mkdir
      pathname: /ci/artifacts/rsync
    
  11. 11 ms: Execute action: mkdir: /ci/secrets
    - action: mkdir
      pathname: /ci/secrets
    
  12. 11 ms: Action succeeded: mkdir: /ci/secrets
    - action: mkdir
      pathname: /ci/secrets
    
  13. 11 ms: Execute action: mkdir: /ci/deps
    - action: mkdir
      pathname: /ci/deps
    
  14. 15 ms: Action succeeded: mkdir: /ci/deps
    - action: mkdir
      pathname: /ci/deps
    
  15. 15 ms: Execute action: tar_extract
    - action: tar_extract
      archive: /dev/vdc
      directory: /ci/src
    
  16. 63 ms: Action succeeded: tar_extract
    - action: tar_extract
      archive: /dev/vdc
      directory: /ci/src
    
  17. 63 ms: Execute action: tar_extract
    - action: tar_extract
      archive: /dev/vdf
      directory: /ci/deps
    
  18. 2396 ms: Action succeeded: tar_extract
    - action: tar_extract
      archive: /dev/vdf
      directory: /ci/deps
    
  19. 2397 ms: Execute action: tar_extract
    - action: tar_extract
      archive: /dev/vde
      directory: /ci/cache
    
  20. 2515 ms: Action succeeded: tar_extract
    - action: tar_extract
      archive: /dev/vde
      directory: /ci/cache
    
  21. 2515 ms: Execute action: tar_extract
    - action: tar_extract
      archive: /dev/vdd
      directory: /ci/artifacts
    
  22. 2535 ms: Action succeeded: tar_extract
    - action: tar_extract
      archive: /dev/vdd
      directory: /ci/artifacts
    
  23. 2543 ms: Execute action: tar_extract
    - action: tar_extract
      archive: /dev/vdg
      directory: /ci/secrets
    
  24. 2557 ms: Action succeeded: tar_extract
    - action: tar_extract
      archive: /dev/vdg
      directory: /ci/secrets
    
  25. 2565 ms: Execute action: shell: ln -sf /ci /workspace
    - action: shell
      shell: ln -sf /ci /workspace
    
  26. 2573 ms: Start program: bash
    • bash
    • -c
    • set -xeuo pipefail ln -sf /ci /workspace
  27. 2605 ms: Program succeeded
    • Exit code: 0
    • Stdout
    • Stderr
      + ln -sf /ci /workspace
      
  28. 2612 ms: Action succeeded: shell: ln -sf /ci /workspace
    - action: shell
      shell: ln -sf /ci /workspace
    
  29. 2620 ms: Execute action: create_file
    - action: create_file
      filename: /root/.ssh/config
      content: "Host *\nStrictHostKeyChecking accept-new\nIdentityFile /ci/secrets/ssh_key\n                "
      overwrite: true
    
  30. 2630 ms: Action succeeded: create_file
    - action: create_file
      filename: /root/.ssh/config
      content: "Host *\nStrictHostKeyChecking accept-new\nIdentityFile /ci/secrets/ssh_key\n                "
      overwrite: true
    
  31. 2636 ms: Execute action: cargo_fmt
    - action: cargo_fmt
    
  32. 2639 ms: Start program: cargo
    • cargo
    • --version
  33. 2772 ms: Program succeeded
    • Exit code: 0
    • Stdout
      cargo 1.96.0 (30a34c682 2026-05-25)
      
    • Stderr
  34. 2777 ms: Start program: cargo
    • cargo
    • clippy
    • --version
  35. 2956 ms: Program succeeded
    • Exit code: 0
    • Stdout
      clippy 0.1.96 (ac68faa20c 2026-05-25)
      
    • Stderr
  36. 2964 ms: Start program: rustc
    • rustc
    • --version
  37. 3043 ms: Program succeeded
    • Exit code: 0
    • Stdout
      rustc 1.96.0 (ac68faa20 2026-05-25)
      
    • Stderr
  38. 3044 ms: Start program: cargo
    • cargo
    • fmt
    • --check
  39. 3279 ms: Program succeeded
    • Exit code: 0
    • Stdout
    • Stderr
  40. 3283 ms: Action succeeded: cargo_fmt
    - action: cargo_fmt
    
  41. 3286 ms: Execute action: cargo_clippy
    - action: cargo_clippy
    
  42. 3290 ms: Start program: cargo
    • cargo
    • --version
  43. 3322 ms: Program succeeded
    • Exit code: 0
    • Stdout
      cargo 1.96.0 (30a34c682 2026-05-25)
      
    • Stderr
  44. 3323 ms: Start program: cargo
    • cargo
    • clippy
    • --version
  45. 3401 ms: Program succeeded
    • Exit code: 0
    • Stdout
      clippy 0.1.96 (ac68faa20c 2026-05-25)
      
    • Stderr
  46. 3404 ms: Start program: rustc
    • rustc
    • --version
  47. 3442 ms: Program succeeded
    • Exit code: 0
    • Stdout
      rustc 1.96.0 (ac68faa20 2026-05-25)
      
    • Stderr
  48. 3446 ms: Start program: cargo
    • cargo
    • clippy
    • --offline
    • --locked
    • --workspace
    • --all-targets
    • --no-deps
    • --
    • --deny
    • warnings
  49. 44163 ms: Program succeeded
    • Exit code: 0
    • Stdout
    • Stderr
         Compiling proc-macro2 v1.0.103
         Compiling unicode-ident v1.0.22
         Compiling quote v1.0.41
         Compiling libc v0.2.177
         Compiling syn v2.0.108
          Checking cfg-if v1.0.4
         Compiling serde_core v1.0.228
         Compiling zerocopy v0.8.27
          Checking memchr v2.7.6
         Compiling rustix v1.1.2
          Checking getrandom v0.2.16
          Checking bitflags v2.10.0
          Checking linux-raw-sys v0.11.0
         Compiling proc-macro-hack v0.5.20+deprecated
          Checking ppv-lite86 v0.2.21
          Checking rand_core v0.6.4
          Checking utf8parse v0.2.2
          Checking anstyle-parse v0.2.7
          Checking rand_chacha v0.3.1
          Checking aho-corasick v1.1.4
          Checking regex-syntax v0.8.8
          Checking colorchoice v1.0.4
         Compiling serde v1.0.228
          Checking anstyle v1.0.13
         Compiling getrandom v0.3.4
          Checking anstyle-query v1.1.4
          Checking is_terminal_polyfill v1.70.2
          Checking anstream v0.6.21
          Checking regex-automata v0.4.13
         Compiling random-number-macro-impl v0.1.8
          Checking rand v0.8.5
         Compiling serde_derive v1.0.228
          Checking ryu v1.0.20
         Compiling thiserror v2.0.17
         Compiling serde_json v1.0.145
          Checking equivalent v1.0.2
          Checking hashbrown v0.16.0
          Checking winnow v0.7.13
          Checking itoa v1.0.15
          Checking toml_parser v1.0.4
          Checking indexmap v2.12.0
          Checking regex v1.12.2
          Checking random-number v0.1.9
          Checking terminal_size v0.4.3
         Compiling thiserror-impl v2.0.17
          Checking serde_spanned v1.0.3
          Checking toml_datetime v0.7.3
          Checking dirs-sys-next v0.1.2
          Checking fastrand v2.3.0
          Checking toml_writer v1.0.4
          Checking unsafe-libyaml-norway v0.2.15
          Checking clap_lex v0.7.6
         Compiling heck v0.5.0
          Checking once_cell v1.21.3
          Checking log v0.4.28
          Checking strsim v0.11.1
          Checking env_filter v0.1.4
          Checking clap_builder v4.5.51
         Compiling clap_derive v4.5.49
          Checking tempfile v3.23.0
          Checking serde_norway v0.9.42
          Checking toml v0.9.8
          Checking directories-next v2.0.0
          Checking random-pick v1.2.16
          Checking jiff v0.2.15
          Checking clingwrap v0.5.0
          Checking passwords v3.1.16
          Checking clap v4.5.51
          Checking env_logger v0.11.8
          Checking sopass v0.6.0 (/ci/src)
          Finished `dev` profile [unoptimized + debuginfo] target(s) in 40.61s
      
  50. 44222 ms: Action succeeded: cargo_clippy
    - action: cargo_clippy
    
  51. 44226 ms: Execute action: cargo_build
    - action: cargo_build
    
  52. 44230 ms: Start program: cargo
    • cargo
    • --version
  53. 44253 ms: Program succeeded
    • Exit code: 0
    • Stdout
      cargo 1.96.0 (30a34c682 2026-05-25)
      
    • Stderr
  54. 44258 ms: Start program: cargo
    • cargo
    • clippy
    • --version
  55. 44345 ms: Program succeeded
    • Exit code: 0
    • Stdout
      clippy 0.1.96 (ac68faa20c 2026-05-25)
      
    • Stderr
  56. 44350 ms: Start program: rustc
    • rustc
    • --version
  57. 44386 ms: Program succeeded
    • Exit code: 0
    • Stdout
      rustc 1.96.0 (ac68faa20 2026-05-25)
      
    • Stderr
  58. 44390 ms: Start program: cargo
    • cargo
    • build
    • --offline
    • --locked
    • --workspace
    • --all-targets
  59. 85120 ms: Program succeeded
    • Exit code: 0
    • Stdout
    • Stderr
         Compiling libc v0.2.177
         Compiling cfg-if v1.0.4
         Compiling serde_core v1.0.228
         Compiling memchr v2.7.6
         Compiling getrandom v0.2.16
         Compiling zerocopy v0.8.27
         Compiling bitflags v2.10.0
         Compiling linux-raw-sys v0.11.0
         Compiling rustix v1.1.2
         Compiling ppv-lite86 v0.2.21
         Compiling rand_core v0.6.4
         Compiling utf8parse v0.2.2
         Compiling anstyle-parse v0.2.7
         Compiling rand_chacha v0.3.1
         Compiling aho-corasick v1.1.4
         Compiling is_terminal_polyfill v1.70.2
         Compiling anstyle v1.0.13
         Compiling regex-syntax v0.8.8
         Compiling colorchoice v1.0.4
         Compiling anstyle-query v1.1.4
         Compiling anstream v0.6.21
         Compiling regex-automata v0.4.13
         Compiling rand v0.8.5
         Compiling itoa v1.0.15
         Compiling winnow v0.7.13
         Compiling ryu v1.0.20
         Compiling equivalent v1.0.2
         Compiling hashbrown v0.16.0
         Compiling indexmap v2.12.0
         Compiling toml_parser v1.0.4
         Compiling regex v1.12.2
         Compiling serde v1.0.228
         Compiling random-number v0.1.9
         Compiling getrandom v0.3.4
         Compiling terminal_size v0.4.3
         Compiling serde_spanned v1.0.3
         Compiling toml_datetime v0.7.3
         Compiling dirs-sys-next v0.1.2
         Compiling unsafe-libyaml-norway v0.2.15
         Compiling once_cell v1.21.3
         Compiling fastrand v2.3.0
         Compiling log v0.4.28
         Compiling toml_writer v1.0.4
         Compiling clap_lex v0.7.6
         Compiling strsim v0.11.1
         Compiling toml v0.9.8
         Compiling clap_builder v4.5.51
         Compiling env_filter v0.1.4
         Compiling tempfile v3.23.0
         Compiling serde_norway v0.9.42
         Compiling directories-next v2.0.0
         Compiling thiserror v2.0.17
         Compiling random-pick v1.2.16
         Compiling serde_json v1.0.145
         Compiling jiff v0.2.15
         Compiling clingwrap v0.5.0
         Compiling passwords v3.1.16
         Compiling clap v4.5.51
         Compiling env_logger v0.11.8
         Compiling sopass v0.6.0 (/ci/src)
          Finished `dev` profile [unoptimized + debuginfo] target(s) in 40.66s
      
  60. 85120 ms: Action succeeded: cargo_build
    - action: cargo_build
    
  61. 85120 ms: Execute action: shell: make sopass.html userguide.html mkdir /ci/artifacts/rsync mv sopass.html userguide.html /ci/artifacts/rsync
    - action: shell
      shell: |
        make sopass.html userguide.html
        mkdir /ci/artifacts/rsync
        mv sopass.html userguide.html /ci/artifacts/rsync
    
  62. 85120 ms: Start program: bash
    • bash
    • -c
    • set -xeuo pipefail make sopass.html userguide.html mkdir /ci/artifacts/rsync mv sopass.html userguide.html /ci/artifacts/rsync
FAILURE
  1. 85386 ms: Program failed
    • Exit code: 1
    • Stdout
      subplot docgen sopass.subplot -o sopass.html
      subplot docgen doc/userguide.subplot -o userguide.html
      
    • Stderr
      + make sopass.html userguide.html
       INFO Starting Subplot
       INFO Subplot finished successfully
       INFO Starting Subplot
       INFO Subplot finished successfully
      + mkdir /ci/artifacts/rsync
      mkdir: cannot create directory ‘/ci/artifacts/rsync’: File exists
      
  2. 85391 ms: Action failed: shell: make sopass.html userguide.html mkdir /ci/artifacts/rsync mv sopass.html userguide.html /ci/artifacts/rsync
    - action: shell
      shell: |
        make sopass.html userguide.html
        mkdir /ci/artifacts/rsync
        mv sopass.html userguide.html /ci/artifacts/rsync
    
  3. 85393 ms: Executor ends in failure
    • Exit code: 1
Console log
BdsDxe: failed to load Boot0001 "UEFI QEMU DVD-ROM QM00005 " from PciRoot(0x0)/Pci(0x1F,0x2)/Sata(0x2,0xFFFF,0x0): Not Found
BdsDxe: loading Boot0002 "UEFI Misc Device" from PciRoot(0x0)/Pci(0x2,0x0)
BdsDxe: starting Boot0002 "UEFI Misc Device" from PciRoot(0x0)/Pci(0x2,0x0)
  Booting `Debian GNU/Linux'

Loading Linux 6.12.86+deb13-amd64 ...
Loading initial ramdisk ...
EFI stub: Loaded initrd from LINUX_EFI_INITRD_MEDIA_GUID device path
Loading, please wait...
Starting systemd-udevd version 257.13-1~deb13u1
Begin: Loading essential drivers ... done.
Begin: Running /scripts/init-premount ... done.
Begin: Mounting root file system ... Begin: Running /scripts/local-top ... done.
Begin: Running /scripts/local-premount ... done.
Begin: Will now check root file system ... fsck from util-linux 2.41
fsck: error 2 (No such file or directory) while executing fsck.ext4 for /dev/vda2
fsck exited with status code 8
done.
Warning: File system check failed but did not detect errors
done.
Begin: Running /scripts/local-bottom ... done.
Begin: Running /scripts/init-bottom ... done.

Welcome to Debian GNU/Linux 13 (trixie)!

[  OK  ] Created slice system-getty.slice - Slice /system/getty.
[  OK  ] Created slice system-modprobe.slice - Slice /system/modprobe.
[  OK  ] Created slice system-serial\x2dget…slice - Slice /system/serial-getty.
[  OK  ] Created slice user.slice - User and Session Slice.
[  OK  ] Started systemd-ask-password-conso…equests to Console Directory Watch.
[  OK  ] Started systemd-ask-password-wall.…d Requests to Wall Directory Watch.
[  OK  ] Set up automount proc-sys-fs-binfm…ormats File System Automount Point.
         Expecting device dev-ttyS0.device - /dev/ttyS0...
[  OK  ] Reached target paths.target - Path Units.
[  OK  ] Reached target remote-fs.target - Remote File Systems.
[  OK  ] Reached target slices.target - Slice Units.
[  OK  ] Reached target swap.target - Swaps.
[  OK  ] Listening on systemd-creds.socket - Credential Encryption/Decryption.
[  OK  ] Listening on systemd-initctl.socke…- initctl Compatibility Named Pipe.
[  OK  ] Listening on systemd-journald-dev-…socket - Journal Socket (/dev/log).
[  OK  ] Listening on systemd-journald.socket - Journal Sockets.
[  OK  ] Listening on systemd-networkd.socket - Network Service Netlink Socket.
[  OK  ] Listening on systemd-udevd-control.socket - udev Control Socket.
[  OK  ] Listening on systemd-udevd-kernel.socket - udev Kernel Socket.
         Mounting dev-hugepages.mount - Huge Pages File System...
         Mounting dev-mqueue.mount - POSIX Message Queue File System...
         Mounting run-lock.mount - Legacy Locks Directory /run/lock...
         Mounting sys-kernel-debug.mount - Kernel Debug File System...
         Mounting sys-kernel-tracing.mount - Kernel Trace File System...
         Mounting tmp.mount - Temporary Directory /tmp...
         Starting kmod-static-nodes.service…eate List of Static Device Nodes...
         Starting modprobe@configfs.service - Load Kernel Module configfs...
         Starting modprobe@drm.service - Load Kernel Module drm...
         Starting modprobe@efi_pstore.servi… - Load Kernel Module efi_pstore...
         Starting modprobe@fuse.service - Load Kernel Module fuse...
         Starting systemd-journald.service - Journal Service...
         Starting systemd-modules-load.service - Load Kernel Modules...
         Starting systemd-network-generator…k Units from Kernel Command Line...
         Starting systemd-remount-fs.servic…unt Root and Kernel File Systems...
         Starting systemd-udev-load-credent…Load udev Rules from Credentials...
         Starting systemd-udev-trigger.service - Coldplug All udev Devices...
[  OK  ] Mounted dev-hugepages.mount - Huge Pages File System.
[  OK  ] Mounted dev-mqueue.mount - POSIX Message Queue File System.
[  OK  ] Mounted run-lock.mount - Legacy Locks Directory /run/lock.
[  OK  ] Mounted sys-kernel-debug.mount - Kernel Debug File System.
[  OK  ] Mounted sys-kernel-tracing.mount - Kernel Trace File System.
[  OK  ] Mounted tmp.mount - Temporary Directory /tmp.
[  OK  ] Finished kmod-static-nodes.service…Create List of Static Device Nodes.
[  OK  ] Finished modprobe@configfs.service - Load Kernel Module configfs.
[  OK  ] Finished modprobe@drm.service - Load Kernel Module drm.
[  OK  ] Finished modprobe@efi_pstore.service - Load Kernel Module efi_pstore.
[  OK  ] Finished modprobe@fuse.service - Load Kernel Module fuse.
[  OK  ] Finished systemd-modules-load.service - Load Kernel Modules.
[  OK  ] Finished systemd-network-generator…ork Units from Kernel Command Line.
[  OK  ] Finished systemd-remount-fs.servic…mount Root and Kernel File Systems.
[  OK  ] Finished systemd-udev-load-credent…- Load udev Rules from Credentials.
[  OK  ] Started systemd-journald.service - Journal Service.
[  OK  ] Reached target network-pre.target - Preparation for Network.
         Mounting sys-fs-fuse-connections.mount - FUSE Control File System...
         Mounting sys-kernel-config.mount - Kernel Configuration File System...
         Starting systemd-journal-flush.ser…sh Journal to Persistent Storage...
         Starting systemd-random-seed.service - Load/Save OS Random Seed...
         Starting systemd-sysctl.service - Apply Kernel Variables...
         Starting systemd-tmpfiles-setup-de… Device Nodes in /dev gracefully...
[  OK  ] Mounted sys-fs-fuse-connections.mount - FUSE Control File System.
[  OK  ] Mounted sys-kernel-config.mount - Kernel Configuration File System.
[  OK  ] Finished systemd-udev-trigger.service - Coldplug All udev Devices.
[  OK  ] Finished systemd-random-seed.service - Load/Save OS Random Seed.
[  OK  ] Finished systemd-sysctl.service - Apply Kernel Variables.
[  OK  ] Finished systemd-tmpfiles-setup-de…ic Device Nodes in /dev gracefully.
         Starting systemd-sysusers.service - Create System Users...
[  OK  ] Finished systemd-journal-flush.ser…lush Journal to Persistent Storage.
[  OK  ] Finished systemd-sysusers.service - Create System Users.
         Starting systemd-resolved.service - Network Name Resolution...
         Starting systemd-tmpfiles-setup-de…eate Static Device Nodes in /dev...
[  OK  ] Finished systemd-tmpfiles-setup-de…Create Static Device Nodes in /dev.
[  OK  ] Reached target local-fs-pre.target…Preparation for Local File Systems.
[  OK  ] Set up automount efi.automount - EFI System Partition Automount.
[  OK  ] Reached target local-fs.target - Local File Systems.
[  OK  ] Listening on systemd-sysext.socket… System Extension Image Management.
         Starting systemd-binfmt.service - Set Up Additional Binary Formats...
         Starting systemd-tmpfiles-setup.se…ate System Files and Directories...
         Starting systemd-udevd.service - R…ager for Device Events and Files...
[  OK  ] Started systemd-resolved.service - Network Name Resolution.
[  OK  ] Finished systemd-tmpfiles-setup.se…reate System Files and Directories.
[  OK  ] Reached target nss-lookup.target - Host and Network Name Lookups.
         Starting ldconfig.service - Rebuild Dynamic Linker Cache...
         Starting systemd-journal-catalog-u…ervice - Rebuild Journal Catalog...
[  OK  ] Started systemd-udevd.service - Ru…anager for Device Events and Files.
         Starting systemd-networkd.service - Network Configuration...
[  OK  ] Finished systemd-journal-catalog-u….service - Rebuild Journal Catalog.
[  OK  ] Found device dev-ttyS0.device - /dev/ttyS0.
         Mounting proc-sys-fs-binfmt_misc.m…cutable File Formats File System...
[  OK  ] Mounted proc-sys-fs-binfmt_misc.mo…xecutable File Formats File System.
[  OK  ] Finished systemd-binfmt.service - Set Up Additional Binary Formats.
[  OK  ] Finished ldconfig.service - Rebuild Dynamic Linker Cache.
         Starting systemd-update-done.service - Update is Completed...
[  OK  ] Finished systemd-update-done.service - Update is Completed.
[  OK  ] Reached target sysinit.target - System Initialization.
[  OK  ] Started apt-daily.timer - Daily apt download activities.
[  OK  ] Started apt-daily-upgrade.timer - …y apt upgrade and clean activities.
[  OK  ] Started dpkg-db-backup.timer - Daily dpkg database backup timer.
[  OK  ] Started fstrim.timer - Discard unused filesystem blocks once a week.
[  OK  ] Started man-db.timer - Daily man-db regeneration.
[  OK  ] Started systemd-tmpfiles-clean.tim…y Cleanup of Temporary Directories.
[  OK  ] Reached target timers.target - Timer Units.
[  OK  ] Listening on dbus.socket - D-Bus System Message Bus Socket.
[  OK  ] Listening on sshd-unix-local.socke…temd-ssh-generator, AF_UNIX Local).
[  OK  ] Listening on systemd-hostnamed.socket - Hostname Service Socket.
[  OK  ] Reached target sockets.target - Socket Units.
[  OK  ] Reached target basic.target - Basic System.
         Starting ambient.service - Run build job for Ambient CI...
         Starting dbus.service - D-Bus System Message Bus...
         Starting grub-common.service - Record successful boot for GRUB...
         Starting systemd-logind.service - User Login Management...
[  OK  ] Started dbus.service - D-Bus System Message Bus.
[  OK  ] Listening on systemd-rfkill.socket…ll Switch Status /dev/rfkill Watch.
[  OK  ] Finished grub-common.service - Record successful boot for GRUB.
[  OK  ] Started systemd-networkd.service - Network Configuration.
[  OK  ] Reached target network.target - Network.
         Starting ssh.service - OpenBSD Secure Shell server...
         Starting systemd-networkd-persiste…tent Storage in systemd-networkd...
         Starting systemd-user-sessions.service - Permit User Sessions...
[  OK  ] Started systemd-logind.service - User Login Management.
[  OK  ] Finished systemd-user-sessions.service - Permit User Sessions.
[  OK  ] Started getty@tty1.service - Getty on tty1.
[  OK  ] Started serial-getty@ttyS0.service - Serial Getty on ttyS0.
[  OK  ] Reached target getty.target - Login Prompts.
[  OK  ] Finished systemd-networkd-persiste…istent Storage in systemd-networkd.
[  OK  ] Started ssh.service - OpenBSD Secure Shell server.

Debian GNU/Linux 13 ambient-dev ttyS0

ambient-dev login: [  OK  ] Stopped ambient.service - Run build job for Ambient CI.
[  OK  ] Removed slice system-modprobe.slice - Slice /system/modprobe.
[  OK  ] Stopped target getty.target - Login Prompts.
[  OK  ] Stopped target nss-lookup.target - Host and Network Name Lookups.
[  OK  ] Stopped target timers.target - Timer Units.
[  OK  ] Stopped apt-daily-upgrade.timer - …y apt upgrade and clean activities.
[  OK  ] Stopped apt-daily.timer - Daily apt download activities.
[  OK  ] Stopped dpkg-db-backup.timer - Daily dpkg database backup timer.
[  OK  ] Stopped fstrim.timer - Discard unused filesystem blocks once a week.
[  OK  ] Stopped man-db.timer - Daily man-db regeneration.
[  OK  ] Stopped systemd-tmpfiles-clean.tim…y Cleanup of Temporary Directories.
[  OK  ] Closed systemd-rfkill.socket - Loa…ll Switch Status /dev/rfkill Watch.
         Stopping dbus.service - D-Bus System Message Bus...
         Stopping getty@tty1.service - Getty on tty1...
         Stopping serial-getty@ttyS0.service - Serial Getty on ttyS0...
         Stopping ssh.service - OpenBSD Secure Shell server...
         Stopping systemd-logind.service - User Login Management...
         Stopping systemd-networkd-persiste…tent Storage in systemd-networkd...
         Stopping systemd-random-seed.service - Load/Save OS Random Seed...
[  OK  ] Stopped systemd-udev-load-credenti…- Load udev Rules from Credentials.
[  OK  ] Stopped dbus.service - D-Bus System Message Bus.
[  OK  ] Stopped ssh.service - OpenBSD Secure Shell server.
[  OK  ] Stopped getty@tty1.service - Getty on tty1.
[  OK  ] Stopped serial-getty@ttyS0.service - Serial Getty on ttyS0.
[  OK  ] Stopped systemd-networkd-persisten…istent Storage in systemd-networkd.
[  OK  ] Stopped systemd-random-seed.service - Load/Save OS Random Seed.
[  OK  ] Stopped systemd-logind.service - User Login Management.
[  OK  ] Removed slice system-getty.slice - Slice /system/getty.
[  OK  ] Removed slice system-serial\x2dget…slice - Slice /system/serial-getty.
         Stopping systemd-user-sessions.service - Permit User Sessions...
[  OK  ] Stopped systemd-user-sessions.service - Permit User Sessions.
[  OK  ] Stopped target basic.target - Basic System.
[  OK  ] Stopped target network.target - Network.
[  OK  ] Stopped target paths.target - Path Units.
[  OK  ] Stopped systemd-ask-password-conso…equests to Console Directory Watch.
[  OK  ] Stopped systemd-ask-password-wall.…d Requests to Wall Directory Watch.
[  OK  ] Stopped target remote-fs.target - Remote File Systems.
[  OK  ] Stopped target slices.target - Slice Units.
[  OK  ] Removed slice user.slice - User and Session Slice.
[  OK  ] Stopped target sockets.target - Socket Units.
[  OK  ] Closed dbus.socket - D-Bus System Message Bus Socket.
[  OK  ] Closed sshd-unix-local.socket - Op…temd-ssh-generator, AF_UNIX Local).
[  OK  ] Closed systemd-hostnamed.socket - Hostname Service Socket.
[  OK  ] Stopped target sysinit.target - System Initialization.
         Stopping systemd-binfmt.service - Set Up Additional Binary Formats...
         Stopping systemd-networkd.service - Network Configuration...
         Stopping systemd-resolved.service - Network Name Resolution...
[  OK  ] Stopped systemd-update-done.service - Update is Completed.
[  OK  ] Stopped ldconfig.service - Rebuild Dynamic Linker Cache.
[  OK  ] Stopped systemd-journal-catalog-up….service - Rebuild Journal Catalog.
[  OK  ] Stopped systemd-tmpfiles-setup.ser…reate System Files and Directories.
[  OK  ] Stopped systemd-networkd.service - Network Configuration.
[  OK  ] Stopped systemd-resolved.service - Network Name Resolution.
[  OK  ] Stopped systemd-binfmt.service - Set Up Additional Binary Formats.
[  OK  ] Unset automount proc-sys-fs-binfmt…ormats File System Automount Point.
[  OK  ] Stopped target local-fs.target - Local File Systems.
[  OK  ] Unset automount efi.automount - EFI System Partition Automount.
[  OK  ] Stopped target local-fs-pre.target…Preparation for Local File Systems.
[  OK  ] Stopped target network-pre.target - Preparation for Network.
[  OK  ] Closed systemd-networkd.socket - Network Service Netlink Socket.
         Unmounting run-lock.mount - Legacy Locks Directory /run/lock...
         Unmounting tmp.mount - Temporary Directory /tmp...
[  OK  ] Stopped systemd-network-generator.…ork Units from Kernel Command Line.
[  OK  ] Stopped systemd-sysctl.service - Apply Kernel Variables.
[  OK  ] Stopped systemd-modules-load.service - Load Kernel Modules.
[  OK  ] Stopped systemd-tmpfiles-setup-dev…Create Static Device Nodes in /dev.
[  OK  ] Stopped systemd-sysusers.service - Create System Users.
[  OK  ] Stopped systemd-remount-fs.service…mount Root and Kernel File Systems.
[  OK  ] Stopped systemd-tmpfiles-setup-dev…ic Device Nodes in /dev gracefully.
[  OK  ] Unmounted tmp.mount - Temporary Directory /tmp.
[  OK  ] Unmounted run-lock.mount - Legacy Locks Directory /run/lock.
[  OK  ] Stopped target swap.target - Swaps.
[  OK  ] Reached target shutdown.target - System Shutdown.
[  OK  ] Reached target umount.target - Unmount All Filesystems.
[  OK  ] Reached target final.target - Late Shutdown Services.
[  OK  ] Finished systemd-poweroff.service - System Power Off.
[  OK  ] Reached target poweroff.target - System Power Off.
[   97.020633] reboot: Power down
Raw run log
BdsDxe: failed to load Boot0001 "UEFI QEMU DVD-ROM QM00005 " from PciRoot(0x0)/Pci(0x1F,0x2)/Sata(0x2,0xFFFF,0x0): Not Found
BdsDxe: loading Boot0002 "UEFI Misc Device" from PciRoot(0x0)/Pci(0x2,0x0)
BdsDxe: starting Boot0002 "UEFI Misc Device" from PciRoot(0x0)/Pci(0x2,0x0)
EFI stub: Loaded initrd from LINUX_EFI_INITRD_MEDIA_GUID device path
INFO: Block devices
NAME   MAJ:MIN RM   SIZE RO TYPE MOUNTPOINTS
vda    254:0    0   100G  0 disk 
├─vda1 254:1    0   953M  0 part 
└─vda2 254:2    0  99.1G  0 part /
vdb    254:16   0   5.3M  1 disk 
vdc    254:32   0   1.4M  1 disk 
vdd    254:48   0 953.7M  0 disk 
vde    254:64   0  27.9G  0 disk 
vdf    254:80   0   100G  1 disk 
vdg    254:96   0    10K  1 disk 
INFO: Extracting tar archive from /dev/vdb
drwxr-xr-x _rad/_rad         0 2026-06-30 14:56 ./
-rw-r--r-- _rad/_rad      1632 2026-06-30 14:57 ./plan.yaml
-rwxr-xr-x _rad/_rad   5517632 2026-06-30 14:57 ./run-ci
INFO: Extracted files:
        6      0 drwxr-xr-x   2 1000     1000           80 Jun 30 14:56 .
       10   5392 -rwxr-xr-x   1 1000     1000      5517632 Jun 30 14:57 ./run-ci
        9      4 -rw-r--r--   1 1000     1000         1632 Jun 30 14:57 ./plan.yaml
INFO: Running run-ci from /dev/vdb
================================ BEGIN ================================
{"type":"executor_starts","name":"ambient-execute-plan","version":"0.15.0@eeab732","timestamp":{"secs_since_epoch":1782831444,"nanos_since_epoch":892003604},"log_source":"Plan"}
{"type":"runnable_plan","steps":[{"action":"mkdir","pathname":"/ci"},{"action":"mkdir","pathname":"/ci/artifacts"},{"action":"mkdir","pathname":"/ci/artifacts/debian"},{"action":"mkdir","pathname":"/ci/artifacts/rsync"},{"action":"mkdir","pathname":"/ci/secrets"},{"action":"mkdir","pathname":"/ci/deps"},{"action":"tar_extract","archive":"/dev/vdc","directory":"/ci/src"},{"action":"tar_extract","archive":"/dev/vdf","directory":"/ci/deps"},{"action":"tar_extract","archive":"/dev/vde","directory":"/ci/cache"},{"action":"tar_extract","archive":"/dev/vdd","directory":"/ci/artifacts"},{"action":"tar_extract","archive":"/dev/vdg","directory":"/ci/secrets"},{"action":"shell","shell":"ln -sf /ci /workspace"},{"action":"create_file","filename":"/root/.ssh/config","content":"Host *\nStrictHostKeyChecking accept-new\nIdentityFile /ci/secrets/ssh_key\n                ","overwrite":true},{"action":"cargo_fmt"},{"action":"cargo_clippy"},{"action":"cargo_build"},{"action":"shell","shell":"make sopass.html userguide.html\nmkdir /ci/artifacts/rsync\nmv sopass.html userguide.html /ci/artifacts/rsync\n"},{"action":"shell","shell":"make OFFLINE=\"--offline --locked\"\ngit clean -fdx\n"},{"action":"custom","name":"dch","args":{"debemail":"liw@liw.fi","debfullname":"Lars Wirzenius"}},{"action":"deb","packages":"debian"},{"action":"tar_create","archive":"/dev/vde","directory":"/ci/cache"},{"action":"tar_create","archive":"/dev/vdd","directory":"/ci/artifacts"}],"executor_drive":"/dev/vdb","source_drive":"/dev/vdc","artifact_drive":"/dev/vdd","cache_drive":"/dev/vde","deps_drive":"/dev/vdf","secrets_drive":null,"workspace_dir":"/ci","source_dir":"/ci/src","deps_dir":"/ci/deps","cache_dir":"/ci/cache","artifacts_dir":"/ci/artifacts","secrets_dir":null,"envs":{},"timestamp":{"secs_since_epoch":1782831444,"nanos_since_epoch":894681751},"log_source":"Plan"}
{"type":"execute_action","action":"mkdir","pathname":"/ci","timestamp":{"secs_since_epoch":1782831444,"nanos_since_epoch":895227751},"log_source":"Plan"}
{"type":"action_succeeded","action":"mkdir","pathname":"/ci","timestamp":{"secs_since_epoch":1782831444,"nanos_since_epoch":896092496},"log_source":"Plan"}
{"type":"execute_action","action":"mkdir","pathname":"/ci/artifacts","timestamp":{"secs_since_epoch":1782831444,"nanos_since_epoch":899345040},"log_source":"Plan"}
{"type":"action_succeeded","action":"mkdir","pathname":"/ci/artifacts","timestamp":{"secs_since_epoch":1782831444,"nanos_since_epoch":899779117},"log_source":"Plan"}
{"type":"execute_action","action":"mkdir","pathname":"/ci/artifacts/debian","timestamp":{"secs_since_epoch":1782831444,"nanos_since_epoch":899996785},"log_source":"Plan"}
{"type":"action_succeeded","action":"mkdir","pathname":"/ci/artifacts/debian","timestamp":{"secs_since_epoch":1782831444,"nanos_since_epoch":902434617},"log_source":"Plan"}
{"type":"execute_action","action":"mkdir","pathname":"/ci/artifacts/rsync","timestamp":{"secs_since_epoch":1782831444,"nanos_since_epoch":902648824},"log_source":"Plan"}
{"type":"action_succeeded","action":"mkdir","pathname":"/ci/artifacts/rsync","timestamp":{"secs_since_epoch":1782831444,"nanos_since_epoch":903046054},"log_source":"Plan"}
{"type":"execute_action","action":"mkdir","pathname":"/ci/secrets","timestamp":{"secs_since_epoch":1782831444,"nanos_since_epoch":903303445},"log_source":"Plan"}
{"type":"action_succeeded","action":"mkdir","pathname":"/ci/secrets","timestamp":{"secs_since_epoch":1782831444,"nanos_since_epoch":903762754},"log_source":"Plan"}
{"type":"execute_action","action":"mkdir","pathname":"/ci/deps","timestamp":{"secs_since_epoch":1782831444,"nanos_since_epoch":903996603},"log_source":"Plan"}
{"type":"action_succeeded","action":"mkdir","pathname":"/ci/deps","timestamp":{"secs_since_epoch":1782831444,"nanos_since_epoch":907551960},"log_source":"Plan"}
{"type":"execute_action","action":"tar_extract","archive":"/dev/vdc","directory":"/ci/src","timestamp":{"secs_since_epoch":1782831444,"nanos_since_epoch":907731209},"log_source":"Plan"}
{"type":"action_succeeded","action":"tar_extract","archive":"/dev/vdc","directory":"/ci/src","timestamp":{"secs_since_epoch":1782831444,"nanos_since_epoch":955431426},"log_source":"Plan"}
{"type":"execute_action","action":"tar_extract","archive":"/dev/vdf","directory":"/ci/deps","timestamp":{"secs_since_epoch":1782831444,"nanos_since_epoch":955497744},"log_source":"Plan"}
{"type":"action_succeeded","action":"tar_extract","archive":"/dev/vdf","directory":"/ci/deps","timestamp":{"secs_since_epoch":1782831447,"nanos_since_epoch":288760729},"log_source":"Plan"}
{"type":"execute_action","action":"tar_extract","archive":"/dev/vde","directory":"/ci/cache","timestamp":{"secs_since_epoch":1782831447,"nanos_since_epoch":289170687},"log_source":"Plan"}
{"type":"action_succeeded","action":"tar_extract","archive":"/dev/vde","directory":"/ci/cache","timestamp":{"secs_since_epoch":1782831447,"nanos_since_epoch":407190017},"log_source":"Plan"}
{"type":"execute_action","action":"tar_extract","archive":"/dev/vdd","directory":"/ci/artifacts","timestamp":{"secs_since_epoch":1782831447,"nanos_since_epoch":407628234},"log_source":"Plan"}
{"type":"action_succeeded","action":"tar_extract","archive":"/dev/vdd","directory":"/ci/artifacts","timestamp":{"secs_since_epoch":1782831447,"nanos_since_epoch":427736961},"log_source":"Plan"}
{"type":"execute_action","action":"tar_extract","archive":"/dev/vdg","directory":"/ci/secrets","timestamp":{"secs_since_epoch":1782831447,"nanos_since_epoch":435265281},"log_source":"Plan"}
{"type":"action_succeeded","action":"tar_extract","archive":"/dev/vdg","directory":"/ci/secrets","timestamp":{"secs_since_epoch":1782831447,"nanos_since_epoch":449918523},"log_source":"Plan"}
{"type":"execute_action","action":"shell","shell":"ln -sf /ci /workspace","timestamp":{"secs_since_epoch":1782831447,"nanos_since_epoch":457183827},"log_source":"Plan"}
{"type":"start_program","argv":[{"Unix":[98,97,115,104]},{"Unix":[45,99]},{"Unix":[115,101,116,32,45,120,101,117,111,32,112,105,112,101,102,97,105,108,10,108,110,32,45,115,102,32,47,99,105,32,47,119,111,114,107,115,112,97,99,101,10]}],"timestamp":{"secs_since_epoch":1782831447,"nanos_since_epoch":465075649},"log_source":"Plan"}
{"type":"program_succeeded","exit_code":0,"stdout":"","stderr":"+ ln -sf /ci /workspace\n","timestamp":{"secs_since_epoch":1782831447,"nanos_since_epoch":497515982},"log_source":"Plan"}
{"type":"action_succeeded","action":"shell","shell":"ln -sf /ci /workspace","timestamp":{"secs_since_epoch":1782831447,"nanos_since_epoch":504704446},"log_source":"Plan"}
{"type":"execute_action","action":"create_file","filename":"/root/.ssh/config","content":"Host *\nStrictHostKeyChecking accept-new\nIdentityFile /ci/secrets/ssh_key\n                ","overwrite":true,"timestamp":{"secs_since_epoch":1782831447,"nanos_since_epoch":512489518},"log_source":"Plan"}
{"type":"action_succeeded","action":"create_file","filename":"/root/.ssh/config","content":"Host *\nStrictHostKeyChecking accept-new\nIdentityFile /ci/secrets/ssh_key\n                ","overwrite":true,"timestamp":{"secs_since_epoch":1782831447,"nanos_since_epoch":522050437},"log_source":"Plan"}
{"type":"execute_action","action":"cargo_fmt","timestamp":{"secs_since_epoch":1782831447,"nanos_since_epoch":528646424},"log_source":"Plan"}
{"type":"start_program","argv":[{"Unix":[99,97,114,103,111]},{"Unix":[45,45,118,101,114,115,105,111,110]}],"timestamp":{"secs_since_epoch":1782831447,"nanos_since_epoch":531762836},"log_source":"Plan"}
{"type":"program_succeeded","exit_code":0,"stdout":"cargo 1.96.0 (30a34c682 2026-05-25)\n","stderr":"","timestamp":{"secs_since_epoch":1782831447,"nanos_since_epoch":664447745},"log_source":"Plan"}
{"type":"start_program","argv":[{"Unix":[99,97,114,103,111]},{"Unix":[99,108,105,112,112,121]},{"Unix":[45,45,118,101,114,115,105,111,110]}],"timestamp":{"secs_since_epoch":1782831447,"nanos_since_epoch":669199162},"log_source":"Plan"}
{"type":"program_succeeded","exit_code":0,"stdout":"clippy 0.1.96 (ac68faa20c 2026-05-25)\n","stderr":"","timestamp":{"secs_since_epoch":1782831447,"nanos_since_epoch":848100425},"log_source":"Plan"}
{"type":"start_program","argv":[{"Unix":[114,117,115,116,99]},{"Unix":[45,45,118,101,114,115,105,111,110]}],"timestamp":{"secs_since_epoch":1782831447,"nanos_since_epoch":856626878},"log_source":"Plan"}
{"type":"program_succeeded","exit_code":0,"stdout":"rustc 1.96.0 (ac68faa20 2026-05-25)\n","stderr":"","timestamp":{"secs_since_epoch":1782831447,"nanos_since_epoch":935982871},"log_source":"Plan"}
{"type":"start_program","argv":[{"Unix":[99,97,114,103,111]},{"Unix":[102,109,116]},{"Unix":[45,45,99,104,101,99,107]}],"timestamp":{"secs_since_epoch":1782831447,"nanos_since_epoch":936787679},"log_source":"Plan"}
{"type":"program_succeeded","exit_code":0,"stdout":"","stderr":"","timestamp":{"secs_since_epoch":1782831448,"nanos_since_epoch":171774055},"log_source":"Plan"}
{"type":"action_succeeded","action":"cargo_fmt","timestamp":{"secs_since_epoch":1782831448,"nanos_since_epoch":175386271},"log_source":"Plan"}
{"type":"execute_action","action":"cargo_clippy","timestamp":{"secs_since_epoch":1782831448,"nanos_since_epoch":178820136},"log_source":"Plan"}
{"type":"start_program","argv":[{"Unix":[99,97,114,103,111]},{"Unix":[45,45,118,101,114,115,105,111,110]}],"timestamp":{"secs_since_epoch":1782831448,"nanos_since_epoch":182019031},"log_source":"Plan"}
{"type":"program_succeeded","exit_code":0,"stdout":"cargo 1.96.0 (30a34c682 2026-05-25)\n","stderr":"","timestamp":{"secs_since_epoch":1782831448,"nanos_since_epoch":214768661},"log_source":"Plan"}
{"type":"start_program","argv":[{"Unix":[99,97,114,103,111]},{"Unix":[99,108,105,112,112,121]},{"Unix":[45,45,118,101,114,115,105,111,110]}],"timestamp":{"secs_since_epoch":1782831448,"nanos_since_epoch":215232929},"log_source":"Plan"}
{"type":"program_succeeded","exit_code":0,"stdout":"clippy 0.1.96 (ac68faa20c 2026-05-25)\n","stderr":"","timestamp":{"secs_since_epoch":1782831448,"nanos_since_epoch":293455741},"log_source":"Plan"}
{"type":"start_program","argv":[{"Unix":[114,117,115,116,99]},{"Unix":[45,45,118,101,114,115,105,111,110]}],"timestamp":{"secs_since_epoch":1782831448,"nanos_since_epoch":296765760},"log_source":"Plan"}
{"type":"program_succeeded","exit_code":0,"stdout":"rustc 1.96.0 (ac68faa20 2026-05-25)\n","stderr":"","timestamp":{"secs_since_epoch":1782831448,"nanos_since_epoch":334149824},"log_source":"Plan"}
{"type":"start_program","argv":[{"Unix":[99,97,114,103,111]},{"Unix":[99,108,105,112,112,121]},{"Unix":[45,45,111,102,102,108,105,110,101]},{"Unix":[45,45,108,111,99,107,101,100]},{"Unix":[45,45,119,111,114,107,115,112,97,99,101]},{"Unix":[45,45,97,108,108,45,116,97,114,103,101,116,115]},{"Unix":[45,45,110,111,45,100,101,112,115]},{"Unix":[45,45]},{"Unix":[45,45,100,101,110,121]},{"Unix":[119,97,114,110,105,110,103,115]}],"timestamp":{"secs_since_epoch":1782831448,"nanos_since_epoch":338778909},"log_source":"Plan"}
{"type":"program_succeeded","exit_code":0,"stdout":"","stderr":"   Compiling proc-macro2 v1.0.103\n   Compiling unicode-ident v1.0.22\n   Compiling quote v1.0.41\n   Compiling libc v0.2.177\n   Compiling syn v2.0.108\n    Checking cfg-if v1.0.4\n   Compiling serde_core v1.0.228\n   Compiling zerocopy v0.8.27\n    Checking memchr v2.7.6\n   Compiling rustix v1.1.2\n    Checking getrandom v0.2.16\n    Checking bitflags v2.10.0\n    Checking linux-raw-sys v0.11.0\n   Compiling proc-macro-hack v0.5.20+deprecated\n    Checking ppv-lite86 v0.2.21\n    Checking rand_core v0.6.4\n    Checking utf8parse v0.2.2\n    Checking anstyle-parse v0.2.7\n    Checking rand_chacha v0.3.1\n    Checking aho-corasick v1.1.4\n    Checking regex-syntax v0.8.8\n    Checking colorchoice v1.0.4\n   Compiling serde v1.0.228\n    Checking anstyle v1.0.13\n   Compiling getrandom v0.3.4\n    Checking anstyle-query v1.1.4\n    Checking is_terminal_polyfill v1.70.2\n    Checking anstream v0.6.21\n    Checking regex-automata v0.4.13\n   Compiling random-number-macro-impl v0.1.8\n    Checking rand v0.8.5\n   Compiling serde_derive v1.0.228\n    Checking ryu v1.0.20\n   Compiling thiserror v2.0.17\n   Compiling serde_json v1.0.145\n    Checking equivalent v1.0.2\n    Checking hashbrown v0.16.0\n    Checking winnow v0.7.13\n    Checking itoa v1.0.15\n    Checking toml_parser v1.0.4\n    Checking indexmap v2.12.0\n    Checking regex v1.12.2\n    Checking random-number v0.1.9\n    Checking terminal_size v0.4.3\n   Compiling thiserror-impl v2.0.17\n    Checking serde_spanned v1.0.3\n    Checking toml_datetime v0.7.3\n    Checking dirs-sys-next v0.1.2\n    Checking fastrand v2.3.0\n    Checking toml_writer v1.0.4\n    Checking unsafe-libyaml-norway v0.2.15\n    Checking clap_lex v0.7.6\n   Compiling heck v0.5.0\n    Checking once_cell v1.21.3\n    Checking log v0.4.28\n    Checking strsim v0.11.1\n    Checking env_filter v0.1.4\n    Checking clap_builder v4.5.51\n   Compiling clap_derive v4.5.49\n    Checking tempfile v3.23.0\n    Checking serde_norway v0.9.42\n    Checking toml v0.9.8\n    Checking directories-next v2.0.0\n    Checking random-pick v1.2.16\n    Checking jiff v0.2.15\n    Checking clingwrap v0.5.0\n    Checking passwords v3.1.16\n    Checking clap v4.5.51\n    Checking env_logger v0.11.8\n    Checking sopass v0.6.0 (/ci/src)\n    Finished `dev` profile [unoptimized + debuginfo] target(s) in 40.61s\n","timestamp":{"secs_since_epoch":1782831489,"nanos_since_epoch":55338274},"log_source":"Plan"}
{"type":"action_succeeded","action":"cargo_clippy","timestamp":{"secs_since_epoch":1782831489,"nanos_since_epoch":114862877},"log_source":"Plan"}
{"type":"execute_action","action":"cargo_build","timestamp":{"secs_since_epoch":1782831489,"nanos_since_epoch":118462274},"log_source":"Plan"}
{"type":"start_program","argv":[{"Unix":[99,97,114,103,111]},{"Unix":[45,45,118,101,114,115,105,111,110]}],"timestamp":{"secs_since_epoch":1782831489,"nanos_since_epoch":122115091},"log_source":"Plan"}
{"type":"program_succeeded","exit_code":0,"stdout":"cargo 1.96.0 (30a34c682 2026-05-25)\n","stderr":"","timestamp":{"secs_since_epoch":1782831489,"nanos_since_epoch":145620519},"log_source":"Plan"}
{"type":"start_program","argv":[{"Unix":[99,97,114,103,111]},{"Unix":[99,108,105,112,112,121]},{"Unix":[45,45,118,101,114,115,105,111,110]}],"timestamp":{"secs_since_epoch":1782831489,"nanos_since_epoch":150714701},"log_source":"Plan"}
{"type":"program_succeeded","exit_code":0,"stdout":"clippy 0.1.96 (ac68faa20c 2026-05-25)\n","stderr":"","timestamp":{"secs_since_epoch":1782831489,"nanos_since_epoch":237503255},"log_source":"Plan"}
{"type":"start_program","argv":[{"Unix":[114,117,115,116,99]},{"Unix":[45,45,118,101,114,115,105,111,110]}],"timestamp":{"secs_since_epoch":1782831489,"nanos_since_epoch":242722738},"log_source":"Plan"}
{"type":"program_succeeded","exit_code":0,"stdout":"rustc 1.96.0 (ac68faa20 2026-05-25)\n","stderr":"","timestamp":{"secs_since_epoch":1782831489,"nanos_since_epoch":278596971},"log_source":"Plan"}
{"type":"start_program","argv":[{"Unix":[99,97,114,103,111]},{"Unix":[98,117,105,108,100]},{"Unix":[45,45,111,102,102,108,105,110,101]},{"Unix":[45,45,108,111,99,107,101,100]},{"Unix":[45,45,119,111,114,107,115,112,97,99,101]},{"Unix":[45,45,97,108,108,45,116,97,114,103,101,116,115]}],"timestamp":{"secs_since_epoch":1782831489,"nanos_since_epoch":282060373},"log_source":"Plan"}
{"type":"program_succeeded","exit_code":0,"stdout":"","stderr":"   Compiling libc v0.2.177\n   Compiling cfg-if v1.0.4\n   Compiling serde_core v1.0.228\n   Compiling memchr v2.7.6\n   Compiling getrandom v0.2.16\n   Compiling zerocopy v0.8.27\n   Compiling bitflags v2.10.0\n   Compiling linux-raw-sys v0.11.0\n   Compiling rustix v1.1.2\n   Compiling ppv-lite86 v0.2.21\n   Compiling rand_core v0.6.4\n   Compiling utf8parse v0.2.2\n   Compiling anstyle-parse v0.2.7\n   Compiling rand_chacha v0.3.1\n   Compiling aho-corasick v1.1.4\n   Compiling is_terminal_polyfill v1.70.2\n   Compiling anstyle v1.0.13\n   Compiling regex-syntax v0.8.8\n   Compiling colorchoice v1.0.4\n   Compiling anstyle-query v1.1.4\n   Compiling anstream v0.6.21\n   Compiling regex-automata v0.4.13\n   Compiling rand v0.8.5\n   Compiling itoa v1.0.15\n   Compiling winnow v0.7.13\n   Compiling ryu v1.0.20\n   Compiling equivalent v1.0.2\n   Compiling hashbrown v0.16.0\n   Compiling indexmap v2.12.0\n   Compiling toml_parser v1.0.4\n   Compiling regex v1.12.2\n   Compiling serde v1.0.228\n   Compiling random-number v0.1.9\n   Compiling getrandom v0.3.4\n   Compiling terminal_size v0.4.3\n   Compiling serde_spanned v1.0.3\n   Compiling toml_datetime v0.7.3\n   Compiling dirs-sys-next v0.1.2\n   Compiling unsafe-libyaml-norway v0.2.15\n   Compiling once_cell v1.21.3\n   Compiling fastrand v2.3.0\n   Compiling log v0.4.28\n   Compiling toml_writer v1.0.4\n   Compiling clap_lex v0.7.6\n   Compiling strsim v0.11.1\n   Compiling toml v0.9.8\n   Compiling clap_builder v4.5.51\n   Compiling env_filter v0.1.4\n   Compiling tempfile v3.23.0\n   Compiling serde_norway v0.9.42\n   Compiling directories-next v2.0.0\n   Compiling thiserror v2.0.17\n   Compiling random-pick v1.2.16\n   Compiling serde_json v1.0.145\n   Compiling jiff v0.2.15\n   Compiling clingwrap v0.5.0\n   Compiling passwords v3.1.16\n   Compiling clap v4.5.51\n   Compiling env_logger v0.11.8\n   Compiling sopass v0.6.0 (/ci/src)\n    Finished `dev` profile [unoptimized + debuginfo] target(s) in 40.66s\n","timestamp":{"secs_since_epoch":1782831530,"nanos_since_epoch":12133951},"log_source":"Plan"}
{"type":"action_succeeded","action":"cargo_build","timestamp":{"secs_since_epoch":1782831530,"nanos_since_epoch":12710799},"log_source":"Plan"}
{"type":"execute_action","action":"shell","shell":"make sopass.html userguide.html\nmkdir /ci/artifacts/rsync\nmv sopass.html userguide.html /ci/artifacts/rsync\n","timestamp":{"secs_since_epoch":1782831530,"nanos_since_epoch":12729134},"log_source":"Plan"}
{"type":"start_program","argv":[{"Unix":[98,97,115,104]},{"Unix":[45,99]},{"Unix":[115,101,116,32,45,120,101,117,111,32,112,105,112,101,102,97,105,108,10,109,97,107,101,32,115,111,112,97,115,115,46,104,116,109,108,32,117,115,101,114,103,117,105,100,101,46,104,116,109,108,10,109,107,100,105,114,32,47,99,105,47,97,114,116,105,102,97,99,116,115,47,114,115,121,110,99,10,109,118,32,115,111,112,97,115,115,46,104,116,109,108,32,117,115,101,114,103,117,105,100,101,46,104,116,109,108,32,47,99,105,47,97,114,116,105,102,97,99,116,115,47,114,115,121,110,99,10,10]}],"timestamp":{"secs_since_epoch":1782831530,"nanos_since_epoch":12748995},"log_source":"Plan"}
{"type":"program_failed","exit_code":1,"stdout":"subplot docgen sopass.subplot -o sopass.html\nsubplot docgen doc/userguide.subplot -o userguide.html\n","stderr":"+ make sopass.html userguide.html\n INFO Starting Subplot\n INFO Subplot finished successfully\n INFO Starting Subplot\n INFO Subplot finished successfully\n+ mkdir /ci/artifacts/rsync\nmkdir: cannot create directory ‘/ci/artifacts/rsync’: File exists\n","timestamp":{"secs_since_epoch":1782831530,"nanos_since_epoch":278161045},"log_source":"Plan"}
{"type":"action_failed","action":"shell","shell":"make sopass.html userguide.html\nmkdir /ci/artifacts/rsync\nmv sopass.html userguide.html /ci/artifacts/rsync\n","timestamp":{"secs_since_epoch":1782831530,"nanos_since_epoch":283339337},"log_source":"Plan"}
ERROR: failed to execute bash
caused by: command failed: "bash": exit code 1
{"type":"executor_ends_in_failure","exit_code":1,"timestamp":{"secs_since_epoch":1782831530,"nanos_since_epoch":285855613},"log_source":"Plan"}
EXIT CODE: 1

Post-plan VM

No log