Run Test: slices-bi-singlenode-login 2026-05-15 17:07:57.302798 CEST - Run: /usr/local/bin/uv pip install --upgrade slices-cli --extra-index-url=https://doc.slices-ri.eu/pypi/ 2026-05-15 17:08:00.574605 CEST - Run: slices --version 2026-05-15 17:08:00.789160 CEST - version: Slices CLI v2025.1.5 Slices CLI core v1.1.2 Slices CLI bi v2.0.2 Slices clientlib core v5.5.1 Slices clientlib bi v5.1.2 2026-05-15 17:08:00.789442 CEST - Run: slices pubkey list --format text 2026-05-15 17:08:01.354588 CEST - Pubkey already registered 2026-05-15 17:08:01.354823 CEST - Run: slices bi infrastructure list --format csv --all --refresh 2026-05-15 17:08:01.920041 CEST - Refreshed infrastructure list. Total: 22 entries. 2026-05-15 17:08:01.920150 CEST - Check List Flavors 2026-05-15 17:08:01.920311 CEST - Run: slices bi --infra gr-volos-bi-vm1 flavor list -f json 2026-05-15 17:08:03.287610 CEST - Check List DiskImages 2026-05-15 17:08:03.287802 CEST - Run: slices bi --infra gr-volos-bi-vm1 diskimage list -f json 2026-05-15 17:08:04.053541 CEST - Requesting resources 2026-05-15 17:08:04.054073 CEST - Cloudinit user data: #!/bin/sh echo "Hello World. The time is now $(date -R)!" | tee '/user_data_output.txt' 2026-05-15 17:08:04.054201 CEST - Run: slices bi --infra gr-volos-bi-vm1 create tst --image 'Ubuntu 24.04.3' --flavor tiny --duration 2h --experiment tst-6555d926 --user-data /tmp/tmpm6xed3xv 2026-05-15 17:08:07.727604 CEST - Resource ID: r_gr-volos-bi-vm1_01krp2wedrez9rp4zhzmy9sh80 2026-05-15 17:08:07.727731 CEST - Waiting until resource ready 2026-05-15 17:08:09.728132 CEST - Run: slices bi --infra gr-volos-bi-vm1 list-resources --format json --experiment tst-6555d926 tst 2026-05-15 17:08:10.594398 CEST - Status: IMAGING 2026-05-15 17:08:13.460761 CEST - Status: IMAGING 2026-05-15 17:08:16.327145 CEST - Status: IMAGING 2026-05-15 17:08:19.294402 CEST - Status: BOOTING 2026-05-15 17:08:22.261305 CEST - Status: BOOTING 2026-05-15 17:08:25.127724 CEST - Status: BOOTING 2026-05-15 17:08:27.994115 CEST - Status: BOOTING 2026-05-15 17:08:30.860495 CEST - Status: BOOTING 2026-05-15 17:08:33.727041 CEST - Status: BOOTING 2026-05-15 17:08:36.693912 CEST - Status: BOOTING 2026-05-15 17:08:39.811117 CEST - Status: BOOTING 2026-05-15 17:08:42.677446 CEST - Status: BOOTING 2026-05-15 17:08:45.544274 CEST - Status: BOOTING 2026-05-15 17:08:48.410703 CEST - Status: BOOTING 2026-05-15 17:08:51.327107 CEST - Status: BOOTING 2026-05-15 17:08:54.244151 CEST - Status: BOOTING 2026-05-15 17:08:57.211330 CEST - Status: BOOTING 2026-05-15 17:09:00.077817 CEST - Status: BOOTING 2026-05-15 17:09:02.944414 CEST - Status: BOOTING 2026-05-15 17:09:05.811448 CEST - Status: BOOTING 2026-05-15 17:09:08.677978 CEST - Status: BOOTING 2026-05-15 17:09:11.595057 CEST - Status: BOOTING 2026-05-15 17:09:14.512056 CEST - Status: BOOTING 2026-05-15 17:09:17.378436 CEST - Status: BOOTING 2026-05-15 17:09:20.244811 CEST - Status: BOOTING 2026-05-15 17:09:23.111382 CEST - Status: BOOTING 2026-05-15 17:09:25.977879 CEST - Status: BOOTING 2026-05-15 17:09:28.844263 CEST - Status: BOOTING 2026-05-15 17:09:31.710575 CEST - Status: BOOTING 2026-05-15 17:09:34.576978 CEST - Status: BOOTING 2026-05-15 17:09:37.443571 CEST - Status: BOOTING 2026-05-15 17:09:40.310024 CEST - Status: BOOTING 2026-05-15 17:09:43.176461 CEST - Status: BOOTING 2026-05-15 17:09:46.043020 CEST - Status: BOOTING 2026-05-15 17:09:48.911829 CEST - Status: BOOTING 2026-05-15 17:09:51.778281 CEST - Status: BOOTING 2026-05-15 17:09:54.646686 CEST - Status: UP 2026-05-15 17:09:54.646764 CEST - Experiment ID: exp_expauth.ilabt.imec.be_01krp2wcs4eejs4a6v4py7ad43 2026-05-15 17:09:54.646809 CEST - Validate resources 2026-05-15 17:09:55.616915 CEST - The fields of the created resource were validated. 2026-05-15 17:09:55.616998 CEST - Check if resources are registered in experiment 2026-05-15 17:09:55.617171 CEST - Run: slices experiment list-resources --format json tst-6555d926 2026-05-15 17:09:56.384326 CEST - Status (on expauth): UP 2026-05-15 17:09:56.384468 CEST - Testing extend expires_at (all resources in experiment) 2026-05-15 17:09:56.384624 CEST - Run: slices bi --infra gr-volos-bi-vm1 extend --duration 3h --experiment tst-6555d926 2026-05-15 17:10:00.208311 CEST - Run: slices bi --infra gr-volos-bi-vm1 list-resources --format json --experiment tst-6555d926 tst 2026-05-15 17:10:01.126148 CEST - Testing extend expires_at (single resource in experiment) 2026-05-15 17:10:01.126317 CEST - Run: slices bi --infra gr-volos-bi-vm1 extend tst --duration 4h --experiment tst-6555d926 2026-05-15 17:10:04.756497 CEST - Run: slices bi --infra gr-volos-bi-vm1 list-resources --format json --experiment tst-6555d926 tst 2026-05-15 17:10:05.673863 CEST - Testing ssh login 2026-05-15 17:10:05.685988 CEST - Run: slices bi --infra gr-volos-bi-vm1 ssh --no-exec --proxy on --show ssh_config --experiment tst-6555d926 tst 2026-05-15 17:10:06.702940 CEST - Run: slices bi --infra gr-volos-bi-vm1 ssh --no-exec --proxy off --show server_pubkey_openssh --experiment tst-6555d926 tst 2026-05-15 17:10:07.770044 CEST - Run: slices bi --infra gr-volos-bi-vm1 ssh --no-exec --proxy off --show proxy_pubkey_openssh --experiment tst-6555d926 tst 2026-05-15 17:10:08.786942 CEST - Logging in using 'slices bi ssh' 2026-05-15 17:10:08.787027 CEST - Forcing IPv4 only. 2026-05-15 17:10:08.787169 CEST - Run: slices bi --infra gr-volos-bi-vm1 ssh --show nothing --experiment tst-6555d926 tst -- -4 uname -a 2026-05-15 17:10:13.413015 CEST - Forcing IPv4 only. 2026-05-15 17:10:13.413184 CEST - Run: slices bi --infra gr-volos-bi-vm1 ssh --show nothing --experiment tst-6555d926 tst -- -4 uptime 2026-05-15 17:10:16.133981 CEST - CLI SSH Test passed. 2026-05-15 17:10:16.134039 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-05-15 17:10:16.134054 CEST - Uptime: 15:10:16 up 1 min, 1 user, load average: 0.73, 0.33, 0.13 2026-05-15 17:10:16.134086 CEST - Logging in using SSH over SSH proxy 2026-05-15 17:10:16.134244 CEST - Run: slices bi --infra gr-volos-bi-vm1 ssh --no-exec --proxy on --show proxy_pubkey_openssh --experiment tst-6555d926 tst 2026-05-15 17:10:17.251733 CEST - Added paramiko HostKeyEntry for 10.64.45.235 2026-05-15 17:10:17.251847 CEST - Added paramiko HostKeyEntry for 10.64.45.235 2026-05-15 17:10:17.251980 CEST - Added paramiko HostKeyEntry for 10.64.45.235 2026-05-15 17:10:17.252229 CEST - Added paramiko HostKeyEntry for [194.177.207.42]:11122 2026-05-15 17:10:17.252304 CEST - Added paramiko HostKeyEntry for [194.177.207.42]:11122 2026-05-15 17:10:17.252342 CEST - Added paramiko HostKeyEntry for [194.177.207.42]:11122 2026-05-15 17:10:17.252354 CEST - Connecting to proxy 194.177.207.42:11122 2026-05-15 17:10:18.127663 CEST - Connecting to 10.64.45.235:22 over proxy 2026-05-15 17:10:19.721098 CEST - SSH Test output: 2026-05-15 17:10:19.721151 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-05-15 17:10:19.721165 CEST - Uptime: 15:10:19 up 1 min, 1 user, load average: 0.75, 0.35, 0.13 2026-05-15 17:10:20.035213 CEST - lsb_release: Ubuntu 24.04.3 LTS 2026-05-15 17:10:20.035293 CEST - lsb_release matches expected value 2026-05-15 17:10:20.035309 CEST - SSH Test passed. 2026-05-15 17:10:20.375250 CEST - Cloud-init user-data: Hello World. The time is now Fri, 15 May 2026 15:09:51 +0000! 2026-05-15 17:10:20.381685 CEST - Destroying tst-6555d926 tst 2026-05-15 17:10:20.381856 CEST - Run: slices bi --infra gr-volos-bi-vm1 destroy --experiment tst-6555d926 tst