Run Test: slices-bi-singlenode-login 2026-06-01 00:17:32.777029 CEST - Run: /usr/local/bin/uv pip compile --upgrade /tmp/tmpp9qvy_1x.package_name --index=https://doc.slices-ri.eu/pypi/ 2026-06-01 00:17:36.651505 CEST - Run: /usr/local/bin/uv pip sync /opt/slices-monitor-worker/slices_monitor_tests/d3706e43-91ea-43a1-a058-44a8396a011e/pip_compile_update_slices-cli.txt --index=https://doc.slices-ri.eu/pypi/ 2026-06-01 00:17:43.533463 CEST - Run: slices --version 2026-06-01 00:17:43.747937 CEST - version: Slices CLI v2026.0.0 Slices CLI core v1.2.3 Slices CLI ai v0.2.1 Slices CLI bi v2.2.0 Slices clientlib bi v6.1.1 Slices clientlib ai v0.3.0 Slices clientlib core v5.5.1 2026-06-01 00:17:43.748200 CEST - Run: slices pubkey list --format text 2026-06-01 00:17:44.313480 CEST - Pubkey already registered 2026-06-01 00:17:44.313740 CEST - Run: slices bi infrastructure list --format csv --all --refresh 2026-06-01 00:17:44.879041 CEST - Refreshed infrastructure list. Total: 22 entries. 2026-06-01 00:17:44.879167 CEST - Check List Flavors 2026-06-01 00:17:44.879335 CEST - Run: slices bi --infra hu-budapest-bi-vm1 flavor list -f json 2026-06-01 00:17:45.845756 CEST - Check List DiskImages 2026-06-01 00:17:45.845976 CEST - Run: slices bi --infra hu-budapest-bi-vm1 diskimage list -f json 2026-06-01 00:17:46.511649 CEST - Requesting resources 2026-06-01 00:17:46.511960 CEST - Run: slices bi --infra hu-budapest-bi-vm1 create tst --image 'Ubuntu 24.04.3' --flavor tiny --duration 2h --experiment tst-65dfd185 2026-06-01 00:17:48.480883 CEST - Resource ID: r_hu-budapest-bi-vm1_01kt01tpzbengszde4m73rx65w 2026-06-01 00:17:48.481003 CEST - Waiting until resource ready 2026-06-01 00:17:50.481513 CEST - Run: slices bi --infra hu-budapest-bi-vm1 list-resources --format json --experiment tst-65dfd185 tst 2026-06-01 00:17:51.247548 CEST - Status: IMAGING 2026-06-01 00:17:54.013826 CEST - Status: IMAGING 2026-06-01 00:17:56.830136 CEST - Status: IMAGING 2026-06-01 00:17:59.596430 CEST - Status: IMAGING 2026-06-01 00:18:02.362793 CEST - Status: IMAGING 2026-06-01 00:18:05.179357 CEST - Status: IMAGING 2026-06-01 00:18:08.096789 CEST - Status: IMAGING 2026-06-01 00:18:10.963476 CEST - Status: IMAGING 2026-06-01 00:18:13.729742 CEST - Status: IMAGING 2026-06-01 00:18:16.648422 CEST - Status: IMAGING 2026-06-01 00:18:19.720862 CEST - Status: IMAGING 2026-06-01 00:18:22.489483 CEST - Status: IMAGING 2026-06-01 00:18:25.256078 CEST - Status: IMAGING 2026-06-01 00:18:28.022690 CEST - Status: IMAGING 2026-06-01 00:18:30.839707 CEST - Status: IMAGING 2026-06-01 00:18:33.606129 CEST - Status: IMAGING 2026-06-01 00:18:36.372654 CEST - Status: IMAGING 2026-06-01 00:18:39.139258 CEST - Status: IMAGING 2026-06-01 00:18:41.905668 CEST - Status: IMAGING 2026-06-01 00:18:44.672102 CEST - Status: IMAGING 2026-06-01 00:18:47.438464 CEST - Status: IMAGING 2026-06-01 00:18:50.305619 CEST - Status: IMAGING 2026-06-01 00:18:53.072106 CEST - Status: IMAGING 2026-06-01 00:18:55.838608 CEST - Status: IMAGING 2026-06-01 00:18:58.605456 CEST - Status: IMAGING 2026-06-01 00:19:01.472418 CEST - Status: IMAGING 2026-06-01 00:19:04.339422 CEST - Status: IMAGING 2026-06-01 00:19:07.156290 CEST - Status: IMAGING 2026-06-01 00:19:09.922903 CEST - Status: IMAGING 2026-06-01 00:19:12.739581 CEST - Status: IMAGING 2026-06-01 00:19:15.606575 CEST - Status: IMAGING 2026-06-01 00:19:18.473333 CEST - Status: IMAGING 2026-06-01 00:19:21.239787 CEST - Status: IMAGING 2026-06-01 00:19:24.056350 CEST - Status: IMAGING 2026-06-01 00:19:26.873170 CEST - Status: UP 2026-06-01 00:19:26.873238 CEST - Experiment ID: exp_expauth.ilabt.imec.be_01kt01tp6rewxakbzafdghtk0h 2026-06-01 00:19:26.873310 CEST - Validate resources 2026-06-01 00:19:27.689885 CEST - The fields of the created resource were validated. 2026-06-01 00:19:27.689987 CEST - Check if resources are registered in experiment 2026-06-01 00:19:27.690183 CEST - Run: slices experiment list-resources --format json tst-65dfd185 2026-06-01 00:19:28.305818 CEST - Status (on expauth): UP 2026-06-01 00:19:28.306028 CEST - Testing extend expires_at (all resources in experiment) 2026-06-01 00:19:28.306193 CEST - Run: slices bi --infra hu-budapest-bi-vm1 extend --duration 3h --experiment tst-65dfd185 2026-06-01 00:19:30.275626 CEST - Run: slices bi --infra hu-budapest-bi-vm1 list-resources --format json --experiment tst-65dfd185 tst 2026-06-01 00:19:31.041839 CEST - Run: slices experiment list-resources --format json tst-65dfd185 2026-06-01 00:19:31.657421 CEST - expires_at (on expauth): 2026-06-01T01:19:00Z (correctly extended) 2026-06-01 00:19:31.657493 CEST - Testing extend expires_at (single resource in experiment) 2026-06-01 00:19:31.657706 CEST - Run: slices bi --infra hu-budapest-bi-vm1 extend tst --duration 4h --experiment tst-65dfd185 2026-06-01 00:19:33.526553 CEST - Run: slices bi --infra hu-budapest-bi-vm1 list-resources --format json --experiment tst-65dfd185 tst 2026-06-01 00:19:34.293050 CEST - Run: slices experiment list-resources --format json tst-65dfd185 2026-06-01 00:19:34.908632 CEST - expires_at (on expauth): 2026-06-01T02:19:00Z (correctly extended) 2026-06-01 00:19:34.908776 CEST - Testing ssh login 2026-06-01 00:19:34.919472 CEST - Run: slices bi --infra hu-budapest-bi-vm1 ssh --no-exec --proxy on --show ssh_config --experiment tst-65dfd185 tst 2026-06-01 00:19:35.886167 CEST - Run: slices bi --infra hu-budapest-bi-vm1 ssh --no-exec --proxy off --show server_pubkey_openssh --experiment tst-65dfd185 tst 2026-06-01 00:19:36.852846 CEST - Run: slices bi --infra hu-budapest-bi-vm1 ssh --no-exec --proxy off --show proxy_pubkey_openssh --experiment tst-65dfd185 tst 2026-06-01 00:19:37.769452 CEST - Logging in using 'slices bi ssh' 2026-06-01 00:19:37.769519 CEST - Forcing IPv4 only. 2026-06-01 00:19:37.769669 CEST - Run: slices bi --infra hu-budapest-bi-vm1 ssh --show nothing --experiment tst-65dfd185 tst -- -4 uname -a 2026-06-01 00:19:41.995643 CEST - Forcing IPv4 only. 2026-06-01 00:19:41.995852 CEST - Run: slices bi --infra hu-budapest-bi-vm1 ssh --show nothing --experiment tst-65dfd185 tst -- -4 uptime 2026-06-01 00:19:43.764920 CEST - CLI SSH Test passed. 2026-06-01 00:19:43.764988 CEST - Uname: Linux 2c1f459e-c69b-436f-aa4f-b148d22ca810-b6fa97cc-9ea7-4f9b-9541-f0 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-01 00:19:43.765004 CEST - Uptime: 22:19:43 up 1 min, 1 user, load average: 0.27, 0.10, 0.03 2026-06-01 00:19:43.765036 CEST - Logging in using SSH over SSH proxy 2026-06-01 00:19:43.765210 CEST - Run: slices bi --infra hu-budapest-bi-vm1 ssh --no-exec --proxy on --show proxy_pubkey_openssh --experiment tst-65dfd185 tst 2026-06-01 00:19:44.681969 CEST - Added paramiko HostKeyEntry for 192.168.0.94 2026-06-01 00:19:44.682074 CEST - Added paramiko HostKeyEntry for 192.168.0.94 2026-06-01 00:19:44.682209 CEST - Added paramiko HostKeyEntry for 192.168.0.94 2026-06-01 00:19:44.682441 CEST - Added paramiko HostKeyEntry for 193.225.251.128 2026-06-01 00:19:44.682486 CEST - Added paramiko HostKeyEntry for 193.225.251.128 2026-06-01 00:19:44.682580 CEST - Added paramiko HostKeyEntry for 193.225.251.128 2026-06-01 00:19:44.682610 CEST - Connecting to proxy 193.225.251.128:22 2026-06-01 00:19:45.221605 CEST - Connecting to 192.168.0.94:22 over proxy 2026-06-01 00:19:45.993002 CEST - SSH Test output: 2026-06-01 00:19:45.993068 CEST - Uname: Linux 2c1f459e-c69b-436f-aa4f-b148d22ca810-b6fa97cc-9ea7-4f9b-9541-f0 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-01 00:19:45.993084 CEST - Uptime: 22:19:45 up 1 min, 1 user, load average: 0.27, 0.10, 0.03 2026-06-01 00:19:46.139252 CEST - lsb_release: Ubuntu 24.04.3 LTS 2026-06-01 00:19:46.139328 CEST - lsb_release matches expected value 2026-06-01 00:19:46.139348 CEST - SSH Test passed. 2026-06-01 00:19:46.146127 CEST - Destroying tst-65dfd185 tst 2026-06-01 00:19:46.146332 CEST - Run: slices bi --infra hu-budapest-bi-vm1 destroy --experiment tst-65dfd185 tst