Using CPython 3.14.6 interpreter at: /usr/local/bin/python3 Creating virtual environment at: .venv Resolved 32 packages in 4.70s Building slices-monitor-test-runner @ file:///app Built slices-monitor-test-runner @ file:///app Prepared 1 package in 517ms warning: Failed to hardlink files; falling back to full copy. This may lead to degraded performance. If the cache and target directories are on different filesystems, hardlinking may not be supported. If this is intentional, set `export UV_LINK_MODE=copy` or use `--link-mode=copy` to suppress this warning. Installed 32 packages in 868ms + annotated-types==0.8.0 + anyio==4.14.2 + authlib==1.7.2 + bcrypt==5.0.0 + certifi==2026.7.22 + cffi==2.1.1 + cryptography==50.0.0 + dnspython==2.8.0 + h11==0.16.0 + httpcore==1.0.9 + httpx==0.28.1 + httpx-oauth==0.17.0 + idna==3.18 + invoke==3.0.3 + joserfc==1.7.4 + msgspec==0.21.1 + packaging==26.3 + paramiko==4.0.0 + pycparser==3.0 + pydantic==2.13.4 + pydantic-core==2.46.4 + pyjwt==2.13.0 + pynacl==1.6.2 + pytz==2026.3.post1 + pyyaml==6.0.3 + slices-clientlib-bi==5.1.2 + slices-clientlib-core==5.6.0 + slices-monitor-test-runner==0.1.dev192+gcac2d3fe6 (from file:///app) + tomli-w==1.2.0 + tomlkit==0.15.1 + typing-extensions==4.16.0 + typing-inspection==0.4.2 Run Test: slices-bi-singlenode-login 2026-08-08 13:16:02.016846 UTC - Installing Slices CLI (latest stable version). 2026-08-08 13:16:02.017343 UTC - Run: /usr/local/bin/uv pip install --index=https://doc.slices-ri.eu/pypi/ slices-cli 2026-08-08 13:16:08.395876 UTC - Slices CLI installed. 2026-08-08 13:16:08.396562 UTC - OS release: PRETTY_NAME="Debian GNU/Linux 13 (trixie)" NAME="Debian GNU/Linux" VERSION_ID="13" VERSION="13 (trixie)" VERSION_CODENAME=trixie DEBIAN_VERSION_FULL=13.5 ID=debian HOME_URL="https://www.debian.org/" SUPPORT_URL="https://www.debian.org/support" BUG_REPORT_URL="https://bugs.debian.org/" 2026-08-08 13:16:08.399957 UTC - ls -a /root/ /scripts/ (error 2): None ls: cannot access '/scripts/': No such file or directory /root/: . .. .cache .local .slices run_test_runner.sh slices-cli-venv 2026-08-08 13:16:08.400060 UTC - env: {'PATH': '/app/.venv/bin:/usr/local/bin:/usr/local/sbin:/usr/local/bin:/usr/sbin:/usr/bin:/sbin:/bin:/root/.local/bin/:/root/slices-cli-venv/bin', 'COLUMNS': '200'} 2026-08-08 13:16:08.400146 UTC - which slices: /app/.venv/bin/slices 2026-08-08 13:16:08.400170 UTC - Slices CLI exe: 'slices' 2026-08-08 13:16:08.400189 UTC - Slices CLI venv path: '/root/slices-cli-venv/' 2026-08-08 13:16:08.400346 UTC - Run: slices --version 2026-08-08 13:16:11.430646 UTC - version: Slices CLI v2026.1.3 Slices CLI core v1.2.6 Slices CLI ai v1.1.0 Slices CLI bi v2.2.1 Slices clientlib bi v6.1.1 Slices clientlib core v5.6.0 Slices clientlib ai v1.0.0 2026-08-08 13:16:11.431013 UTC - Run: slices pubkey list --format text 2026-08-08 13:16:12.497072 UTC - Pubkey already registered 2026-08-08 13:16:12.497316 UTC - Run: slices bi infrastructure list --format csv --all --refresh 2026-08-08 13:16:13.162764 UTC - Refreshed infrastructure list. Total: 24 entries. 2026-08-08 13:16:13.162862 UTC - Check List Flavors 2026-08-08 13:16:13.163011 UTC - Run: slices bi --infra de-munich-bi-vm flavor list -f json 2026-08-08 13:16:13.928682 UTC - Check List DiskImages 2026-08-08 13:16:13.928951 UTC - Run: slices bi --infra de-munich-bi-vm diskimage list -f json 2026-08-08 13:16:14.699041 UTC - Requesting resources 2026-08-08 13:16:14.699532 UTC - Cloudinit user data: #!/bin/sh echo "Hello World. The time is now $(date -R)!" | tee '/user_data_output.txt' 2026-08-08 13:16:14.699646 UTC - Run: slices bi --infra de-munich-bi-vm create tst --image 'Ubuntu 24.04.3' --flavor tiny --duration 2h --experiment tst-d411794e --user-data /tmp/tmptjynyx1z 2026-08-08 13:16:16.371238 UTC - Resource ID: r_de-munich-bi-vm_01kzgr8qddfc8t2c2p8b9ygbdp 2026-08-08 13:16:16.371414 UTC - Waiting until resource ready 2026-08-08 13:16:18.372078 UTC - Run: slices bi --infra de-munich-bi-vm list-resources --format json --experiment tst-d411794e tst 2026-08-08 13:16:19.352124 UTC - Status: IMAGING 2026-08-08 13:16:22.747287 UTC - Status: BOOTING 2026-08-08 13:16:25.679973 UTC - Status: BOOTING 2026-08-08 13:16:28.797963 UTC - Status: BOOTING 2026-08-08 13:16:32.320797 UTC - Status: BOOTING 2026-08-08 13:16:35.441240 UTC - Status: BOOTING 2026-08-08 13:16:38.677858 UTC - Status: BOOTING 2026-08-08 13:16:41.702593 UTC - Status: UP 2026-08-08 13:16:41.702674 UTC - Experiment ID: exp_expauth.ilabt.imec.be_01kzgr8prteyqrhwty2avfkfy0 2026-08-08 13:16:41.702719 UTC - Validate resources 2026-08-08 13:16:42.573657 UTC - The fields of the created resource were validated. 2026-08-08 13:16:42.573785 UTC - Check if resources are registered in experiment 2026-08-08 13:16:42.573979 UTC - Run: slices experiment list-resources --format json tst-d411794e 2026-08-08 13:16:43.922110 UTC - Status (on expauth): UP 2026-08-08 13:16:43.922449 UTC - Testing extend expires_at (all resources in experiment) 2026-08-08 13:16:43.922588 UTC - Run: slices bi --infra de-munich-bi-vm extend --duration 3h --experiment tst-d411794e 2026-08-08 13:16:45.600578 UTC - Run: slices bi --infra de-munich-bi-vm list-resources --format json --experiment tst-d411794e tst 2026-08-08 13:16:47.801799 UTC - Run: slices experiment list-resources --format json tst-d411794e 2026-08-08 13:16:49.064808 UTC - expires_at (on expauth): 2026-08-08T16:16:00Z (correctly extended) 2026-08-08 13:16:49.065028 UTC - Testing extend expires_at (single resource in experiment) 2026-08-08 13:16:49.065193 UTC - Run: slices bi --infra de-munich-bi-vm extend tst --duration 4h --experiment tst-d411794e 2026-08-08 13:16:51.124174 UTC - Run: slices bi --infra de-munich-bi-vm list-resources --format json --experiment tst-d411794e tst 2026-08-08 13:16:53.062758 UTC - Run: slices experiment list-resources --format json tst-d411794e 2026-08-08 13:16:54.907793 UTC - expires_at (on expauth): 2026-08-08T17:16:00Z (correctly extended) 2026-08-08 13:16:54.907914 UTC - Testing ssh login 2026-08-08 13:16:54.957194 UTC - Run: slices bi --infra de-munich-bi-vm ssh --no-exec --proxy on --show ssh_config --experiment tst-d411794e tst 2026-08-08 13:16:57.007103 UTC - Run: slices bi --infra de-munich-bi-vm ssh --no-exec --proxy off --show server_pubkey_openssh --experiment tst-d411794e tst 2026-08-08 13:16:59.097195 UTC - Run: slices bi --infra de-munich-bi-vm ssh --no-exec --proxy off --show proxy_pubkey_openssh --experiment tst-d411794e tst 2026-08-08 13:17:01.382136 UTC - Logging in using 'slices bi ssh' 2026-08-08 13:17:01.382206 UTC - Forcing IPv4 only. 2026-08-08 13:17:01.382320 UTC - Run: slices bi --infra de-munich-bi-vm ssh --show nothing --experiment tst-d411794e tst -- -4 uname -a 2026-08-08 13:17:05.385612 UTC - Forcing IPv4 only. 2026-08-08 13:17:05.385946 UTC - Run: slices bi --infra de-munich-bi-vm ssh --show nothing --experiment tst-d411794e tst -- -4 uptime 2026-08-08 13:17:07.576088 UTC - CLI SSH Test passed. 2026-08-08 13:17:07.576207 UTC - Uname: Linux tst 6.8.0-85-generic #85-Ubuntu SMP PREEMPT_DYNAMIC Thu Sep 18 15:26:59 UTC 2025 x86_64 x86_64 x86_64 GNU/Linux 2026-08-08 13:17:07.576229 UTC - Uptime: 13:17:07 up 0 min, 1 user, load average: 0.23, 0.07, 0.02 2026-08-08 13:17:07.576275 UTC - Logging in using SSH over SSH proxy 2026-08-08 13:17:07.576443 UTC - Run: slices bi --infra de-munich-bi-vm ssh --no-exec --proxy on --show proxy_pubkey_openssh --experiment tst-d411794e tst 2026-08-08 13:17:09.061621 UTC - Added paramiko HostKeyEntry for 172.30.255.5 2026-08-08 13:17:09.061841 UTC - Added paramiko HostKeyEntry for 172.30.255.5 2026-08-08 13:17:09.061906 UTC - Added paramiko HostKeyEntry for 172.30.255.5 2026-08-08 13:17:09.062408 UTC - Added paramiko HostKeyEntry for [tripwire.net.in.tum.de]:10022 2026-08-08 13:17:09.062520 UTC - Added paramiko HostKeyEntry for [tripwire.net.in.tum.de]:10022 2026-08-08 13:17:09.062576 UTC - Added paramiko HostKeyEntry for [tripwire.net.in.tum.de]:10022 2026-08-08 13:17:09.062596 UTC - Connecting to proxy tripwire.net.in.tum.de:10022 2026-08-08 13:17:09.464439 UTC - Connecting to 172.30.255.5:22 over proxy 2026-08-08 13:17:10.145189 UTC - SSH Test output: 2026-08-08 13:17:10.145270 UTC - Uname: Linux tst 6.8.0-85-generic #85-Ubuntu SMP PREEMPT_DYNAMIC Thu Sep 18 15:26:59 UTC 2025 x86_64 x86_64 x86_64 GNU/Linux 2026-08-08 13:17:10.145302 UTC - Uptime: 13:17:09 up 0 min, 1 user, load average: 0.23, 0.07, 0.02 2026-08-08 13:17:10.280978 UTC - lsb_release: Ubuntu 24.04.3 LTS 2026-08-08 13:17:10.281053 UTC - lsb_release matches expected value 2026-08-08 13:17:10.281073 UTC - SSH Test passed. 2026-08-08 13:17:10.417011 UTC - Cloud-init user-data: Hello World. The time is now Sat, 08 Aug 2026 13:16:38 +0000! 2026-08-08 13:17:10.436503 UTC - Destroying tst-d411794e tst 2026-08-08 13:17:10.436691 UTC - Run: slices bi --infra de-munich-bi-vm destroy --experiment tst-d411794e tst