Run Test: slices-bi-singlenode-login 2026-06-09 17:15:18.961577 CEST - Run: /usr/local/bin/uv pip compile --upgrade /tmp/tmpbi8eref9.package_name --index=https://doc.slices-ri.eu/pypi/ 2026-06-09 17:15:23.237848 CEST - Run: /usr/local/bin/uv pip sync /opt/slices-monitor-worker/slices_monitor_tests/73e94731-93ef-4e7e-ad2a-e0e7b7456462/pip_compile_update_slices-cli.txt --index=https://doc.slices-ri.eu/pypi/ 2026-06-09 17:15:31.524851 CEST - Run: slices --version 2026-06-09 17:15:31.789660 CEST - version: Slices CLI v2026.1.2 Slices CLI core v1.2.4 Slices CLI ai v1.1.0 Slices CLI bi v2.2.0 Slices clientlib bi v6.1.1 Slices clientlib ai v1.0.0 Slices clientlib core v5.5.1 2026-06-09 17:15:31.789987 CEST - Run: slices pubkey list --format text 2026-06-09 17:15:32.355511 CEST - Pubkey already registered 2026-06-09 17:15:32.355773 CEST - Run: slices bi infrastructure list --format csv --all --refresh 2026-06-09 17:15:32.921504 CEST - Refreshed infrastructure list. Total: 23 entries. 2026-06-09 17:15:32.921634 CEST - Check List Flavors 2026-06-09 17:15:32.921818 CEST - Run: slices bi --infra gr-volos-bi-vm1 flavor list -f json 2026-06-09 17:15:33.888490 CEST - Check List DiskImages 2026-06-09 17:15:33.888768 CEST - Run: slices bi --infra gr-volos-bi-vm1 diskimage list -f json 2026-06-09 17:15:34.705004 CEST - Requesting resources 2026-06-09 17:15:34.705383 CEST - Cloudinit user data: #!/bin/sh echo "Hello World. The time is now $(date -R)!" | tee '/user_data_output.txt' 2026-06-09 17:15:34.705493 CEST - Run: slices bi --infra gr-volos-bi-vm1 create tst --image 'Ubuntu 24.04.3' --flavor tiny --duration 2h --experiment tst-6e173dc0 --user-data /tmp/tmprdyrha8z 2026-06-09 17:15:37.327404 CEST - Resource ID: r_gr-volos-bi-vm1_01ktpf84frees90t0vdkaa8ywc 2026-06-09 17:15:37.327552 CEST - Waiting until resource ready 2026-06-09 17:15:39.328058 CEST - Run: slices bi --infra gr-volos-bi-vm1 list-resources --format json --experiment tst-6e173dc0 tst 2026-06-09 17:15:40.194623 CEST - Status: IMAGING 2026-06-09 17:15:43.111780 CEST - Status: IMAGING 2026-06-09 17:15:46.029940 CEST - Status: IMAGING 2026-06-09 17:15:48.897417 CEST - Status: BOOTING 2026-06-09 17:15:51.767120 CEST - Status: BOOTING 2026-06-09 17:15:54.686215 CEST - Status: BOOTING 2026-06-09 17:15:57.553127 CEST - Status: BOOTING 2026-06-09 17:16:00.421366 CEST - Status: BOOTING 2026-06-09 17:16:03.288302 CEST - Status: BOOTING 2026-06-09 17:16:06.154921 CEST - Status: BOOTING 2026-06-09 17:16:09.121877 CEST - Status: BOOTING 2026-06-09 17:16:12.089109 CEST - Status: BOOTING 2026-06-09 17:16:14.955858 CEST - Status: BOOTING 2026-06-09 17:16:17.822661 CEST - Status: BOOTING 2026-06-09 17:16:20.840562 CEST - Status: BOOTING 2026-06-09 17:16:23.707472 CEST - Status: BOOTING 2026-06-09 17:16:26.624502 CEST - Status: BOOTING 2026-06-09 17:16:29.591649 CEST - Status: BOOTING 2026-06-09 17:16:32.458557 CEST - Status: BOOTING 2026-06-09 17:16:35.425733 CEST - Status: BOOTING 2026-06-09 17:16:38.292485 CEST - Status: BOOTING 2026-06-09 17:16:41.159213 CEST - Status: BOOTING 2026-06-09 17:16:44.026081 CEST - Status: BOOTING 2026-06-09 17:16:46.892859 CEST - Status: BOOTING 2026-06-09 17:16:49.809942 CEST - Status: BOOTING 2026-06-09 17:16:52.726936 CEST - Status: BOOTING 2026-06-09 17:16:55.593608 CEST - Status: BOOTING 2026-06-09 17:16:58.510523 CEST - Status: BOOTING 2026-06-09 17:17:01.377252 CEST - Status: BOOTING 2026-06-09 17:17:04.243940 CEST - Status: BOOTING 2026-06-09 17:17:07.110771 CEST - Status: BOOTING 2026-06-09 17:17:10.078081 CEST - Status: BOOTING 2026-06-09 17:17:12.944739 CEST - Status: BOOTING 2026-06-09 17:17:15.811364 CEST - Status: BOOTING 2026-06-09 17:17:18.678515 CEST - Status: BOOTING 2026-06-09 17:17:21.595491 CEST - Status: BOOTING 2026-06-09 17:17:25.464817 CEST - Status: BOOTING 2026-06-09 17:17:28.331596 CEST - Status: BOOTING 2026-06-09 17:17:31.298532 CEST - Status: BOOTING 2026-06-09 17:17:34.165243 CEST - Status: BOOTING 2026-06-09 17:17:37.031991 CEST - Status: BOOTING 2026-06-09 17:17:39.948961 CEST - Status: BOOTING 2026-06-09 17:17:42.815605 CEST - Status: BOOTING 2026-06-09 17:17:45.782656 CEST - Status: UP 2026-06-09 17:17:45.782737 CEST - Experiment ID: exp_expauth.ilabt.imec.be_01ktpf836gfxysr8kdayf7fa4y 2026-06-09 17:17:45.782779 CEST - Validate resources 2026-06-09 17:17:47.000187 CEST - The fields of the created resource were validated. 2026-06-09 17:17:47.000291 CEST - Check if resources are registered in experiment 2026-06-09 17:17:47.000505 CEST - Run: slices experiment list-resources --format json tst-6e173dc0 2026-06-09 17:17:47.616498 CEST - Status (on expauth): UP 2026-06-09 17:17:47.616681 CEST - Testing extend expires_at (all resources in experiment) 2026-06-09 17:17:47.616849 CEST - Run: slices bi --infra gr-volos-bi-vm1 extend --duration 3h --experiment tst-6e173dc0 2026-06-09 17:17:52.644941 CEST - Run: slices bi --infra gr-volos-bi-vm1 list-resources --format json --experiment tst-6e173dc0 tst 2026-06-09 17:17:53.511194 CEST - Run: slices experiment list-resources --format json tst-6e173dc0 2026-06-09 17:17:54.126723 CEST - expires_at (on expauth): 2026-06-09T18:17:00Z (correctly extended) 2026-06-09 17:17:54.126798 CEST - Testing extend expires_at (single resource in experiment) 2026-06-09 17:17:54.126944 CEST - Run: slices bi --infra gr-volos-bi-vm1 extend tst --duration 4h --experiment tst-6e173dc0 2026-06-09 17:17:56.497241 CEST - Run: slices bi --infra gr-volos-bi-vm1 list-resources --format json --experiment tst-6e173dc0 tst 2026-06-09 17:17:57.413833 CEST - Run: slices experiment list-resources --format json tst-6e173dc0 2026-06-09 17:17:58.029531 CEST - expires_at (on expauth): 2026-06-09T19:17:00Z (correctly extended) 2026-06-09 17:17:58.029664 CEST - Testing ssh login 2026-06-09 17:17:58.040739 CEST - Run: slices bi --infra gr-volos-bi-vm1 ssh --no-exec --proxy on --show ssh_config --experiment tst-6e173dc0 tst 2026-06-09 17:17:59.057672 CEST - Run: slices bi --infra gr-volos-bi-vm1 ssh --no-exec --proxy off --show server_pubkey_openssh --experiment tst-6e173dc0 tst 2026-06-09 17:18:00.074722 CEST - Run: slices bi --infra gr-volos-bi-vm1 ssh --no-exec --proxy off --show proxy_pubkey_openssh --experiment tst-6e173dc0 tst 2026-06-09 17:18:01.091288 CEST - Logging in using 'slices bi ssh' 2026-06-09 17:18:01.091358 CEST - Forcing IPv4 only. 2026-06-09 17:18:01.091509 CEST - Run: slices bi --infra gr-volos-bi-vm1 ssh --show nothing --experiment tst-6e173dc0 tst -- -4 uname -a 2026-06-09 17:18:05.066241 CEST - Forcing IPv4 only. 2026-06-09 17:18:05.066423 CEST - Run: slices bi --infra gr-volos-bi-vm1 ssh --show nothing --experiment tst-6e173dc0 tst -- -4 uptime 2026-06-09 17:18:07.587189 CEST - CLI SSH Test passed. 2026-06-09 17:18:07.587253 CEST - 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-06-09 17:18:07.587266 CEST - Uptime: 15:18:07 up 2 min, 1 user, load average: 0.85, 0.51, 0.20 2026-06-09 17:18:07.587299 CEST - Logging in using SSH over SSH proxy 2026-06-09 17:18:07.587467 CEST - Run: slices bi --infra gr-volos-bi-vm1 ssh --no-exec --proxy on --show proxy_pubkey_openssh --experiment tst-6e173dc0 tst 2026-06-09 17:18:08.604401 CEST - Added paramiko HostKeyEntry for 10.64.45.212 2026-06-09 17:18:08.604532 CEST - Added paramiko HostKeyEntry for 10.64.45.212 2026-06-09 17:18:08.604672 CEST - Added paramiko HostKeyEntry for 10.64.45.212 2026-06-09 17:18:08.604961 CEST - Added paramiko HostKeyEntry for [194.177.207.42]:11122 2026-06-09 17:18:08.605047 CEST - Added paramiko HostKeyEntry for [194.177.207.42]:11122 2026-06-09 17:18:08.605086 CEST - Added paramiko HostKeyEntry for [194.177.207.42]:11122 2026-06-09 17:18:08.605102 CEST - Connecting to proxy 194.177.207.42:11122 2026-06-09 17:18:09.345459 CEST - Connecting to 10.64.45.212:22 over proxy 2026-06-09 17:18:10.822889 CEST - SSH Test output: 2026-06-09 17:18:10.822946 CEST - 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-06-09 17:18:10.822960 CEST - Uptime: 15:18:10 up 2 min, 1 user, load average: 0.86, 0.52, 0.21 2026-06-09 17:18:11.128847 CEST - lsb_release: Ubuntu 24.04.3 LTS 2026-06-09 17:18:11.128917 CEST - lsb_release matches expected value 2026-06-09 17:18:11.128931 CEST - SSH Test passed. 2026-06-09 17:18:11.432424 CEST - Cloud-init user-data: Hello World. The time is now Tue, 09 Jun 2026 15:17:40 +0000! 2026-06-09 17:18:11.439602 CEST - Destroying tst-6e173dc0 tst 2026-06-09 17:18:11.439813 CEST - Run: slices bi --infra gr-volos-bi-vm1 destroy --experiment tst-6e173dc0 tst