2026-04-22 02:20:07.882370 | Job console starting 2026-04-22 02:20:07.899634 | Updating git repos 2026-04-22 02:20:08.014441 | Cloning repos into workspace 2026-04-22 02:20:08.380187 | Restoring repo states 2026-04-22 02:20:08.399947 | Merging changes 2026-04-22 02:20:09.538088 | Checking out repos 2026-04-22 02:20:09.661307 | Preparing playbooks 2026-04-22 02:20:15.277168 | Running Ansible setup 2026-04-22 02:20:19.420138 | PRE-RUN START: [trusted : github.com/vexxhost/zuul-config/playbooks/base/pre.yaml@main] 2026-04-22 02:20:20.074568 | 2026-04-22 02:20:20.074715 | PLAY [localhost] 2026-04-22 02:20:20.083528 | 2026-04-22 02:20:20.083611 | TASK [Gathering Facts] 2026-04-22 02:20:20.947594 | localhost | ok 2026-04-22 02:20:20.959467 | 2026-04-22 02:20:20.959542 | TASK [Setup log path fact] 2026-04-22 02:20:20.979327 | localhost | ok 2026-04-22 02:20:21.034333 | 2026-04-22 02:20:21.034410 | TASK [set-zuul-log-path-fact : Set log path for a build] 2026-04-22 02:20:21.064534 | localhost | ok 2026-04-22 02:20:21.075796 | 2026-04-22 02:20:21.075869 | TASK [emit-job-header : Print job information] 2026-04-22 02:20:21.117029 | # Job Information 2026-04-22 02:20:21.117276 | Ansible Version: 2.16.16 2026-04-22 02:20:21.117348 | Job: ansible-collection-kubernetes-molecule-upload-helm-chart 2026-04-22 02:20:21.117398 | Pipeline: check 2026-04-22 02:20:21.117445 | Executor: 0a8996d2b663 2026-04-22 02:20:21.117489 | Triggered by: https://github.com/vexxhost/ansible-collection-kubernetes/pull/267 2026-04-22 02:20:21.117543 | Event ID: aa481760-3df1-11f1-80e5-a0e2fb1d2e26 2026-04-22 02:20:21.122337 | 2026-04-22 02:20:21.122401 | LOOP [emit-job-header : Print node information] 2026-04-22 02:20:21.215662 | localhost | ok: 2026-04-22 02:20:21.302839 | localhost | # Node Information 2026-04-22 02:20:21.303048 | localhost | Inventory Hostname: controller 2026-04-22 02:20:21.303111 | localhost | Hostname: np0000169047 2026-04-22 02:20:21.303160 | localhost | Username: zuul 2026-04-22 02:20:21.303216 | localhost | Distro: Debian 13.4 2026-04-22 02:20:21.303263 | localhost | Provider: yul1 2026-04-22 02:20:21.303309 | localhost | Region: ca-ymq-1 2026-04-22 02:20:21.303355 | localhost | Label: debian-trixie 2026-04-22 02:20:21.303400 | localhost | Product Name: OpenStack Nova 2026-04-22 02:20:21.303444 | localhost | Interface IP: 199.19.213.196 2026-04-22 02:20:21.317535 | 2026-04-22 02:20:21.317695 | TASK [log-inventory : Ensure Zuul Ansible directory exists] 2026-04-22 02:20:21.801032 | localhost -> localhost | changed 2026-04-22 02:20:21.807389 | 2026-04-22 02:20:21.807476 | TASK [log-inventory : Copy ansible inventory to logs dir] 2026-04-22 02:20:22.735187 | localhost -> localhost | changed 2026-04-22 02:20:22.743790 | 2026-04-22 02:20:22.743851 | PLAY [all] 2026-04-22 02:20:22.756295 | 2026-04-22 02:20:22.756488 | TASK [add-build-sshkey : Check to see if ssh key was already created for this build] 2026-04-22 02:20:23.146123 | controller -> localhost | ok 2026-04-22 02:20:23.153493 | 2026-04-22 02:20:23.153562 | TASK [add-build-sshkey : Create a new key in workspace based on build UUID] 2026-04-22 02:20:23.182331 | controller | ok 2026-04-22 02:20:23.197194 | controller | included: /var/lib/zuul/builds/2d53591f7af84d9a8fcdd1055f1f722a/trusted/project_1/opendev.org/zuul/zuul-jobs/roles/add-build-sshkey/tasks/create-key-and-replace.yaml 2026-04-22 02:20:23.202469 | 2026-04-22 02:20:23.202540 | TASK [add-build-sshkey : Create Temp SSH key] 2026-04-22 02:20:24.270759 | controller -> localhost | Generating public/private rsa key pair. 2026-04-22 02:20:24.270941 | controller -> localhost | Your identification has been saved in /var/lib/zuul/builds/2d53591f7af84d9a8fcdd1055f1f722a/work/2d53591f7af84d9a8fcdd1055f1f722a_id_rsa 2026-04-22 02:20:24.270972 | controller -> localhost | Your public key has been saved in /var/lib/zuul/builds/2d53591f7af84d9a8fcdd1055f1f722a/work/2d53591f7af84d9a8fcdd1055f1f722a_id_rsa.pub 2026-04-22 02:20:24.270996 | controller -> localhost | The key fingerprint is: 2026-04-22 02:20:24.271017 | controller -> localhost | SHA256:sMyva0pkWoIZFDLDpZVMHsB2nROTF5jCGgPPOKR2eRI zuul-build-sshkey 2026-04-22 02:20:24.271048 | controller -> localhost | The key's randomart image is: 2026-04-22 02:20:24.271070 | controller -> localhost | +---[RSA 3072]----+ 2026-04-22 02:20:24.271093 | controller -> localhost | |O=BEoo*.. | 2026-04-22 02:20:24.271115 | controller -> localhost | |=%+*+B.. | 2026-04-22 02:20:24.271137 | controller -> localhost | |*oB=..+ | 2026-04-22 02:20:24.271158 | controller -> localhost | |.*. oo o | 2026-04-22 02:20:24.271178 | controller -> localhost | |o . + + S | 2026-04-22 02:20:24.271199 | controller -> localhost | | * . | 2026-04-22 02:20:24.271219 | controller -> localhost | | . . . | 2026-04-22 02:20:24.271240 | controller -> localhost | | . .. | 2026-04-22 02:20:24.271264 | controller -> localhost | | .oo. | 2026-04-22 02:20:24.271285 | controller -> localhost | +----[SHA256]-----+ 2026-04-22 02:20:24.271333 | controller -> localhost | ok: Runtime: 0:00:00.629597 2026-04-22 02:20:24.277350 | 2026-04-22 02:20:24.277419 | TASK [add-build-sshkey : Remote setup ssh keys (linux)] 2026-04-22 02:20:24.313555 | controller | ok 2026-04-22 02:20:24.322208 | controller | included: /var/lib/zuul/builds/2d53591f7af84d9a8fcdd1055f1f722a/trusted/project_1/opendev.org/zuul/zuul-jobs/roles/add-build-sshkey/tasks/remote-linux.yaml 2026-04-22 02:20:24.329801 | 2026-04-22 02:20:24.329868 | TASK [add-build-sshkey : Remove previously added zuul-build-sshkey] 2026-04-22 02:20:24.354738 | controller | skipping: Conditional result was False 2026-04-22 02:20:24.367089 | 2026-04-22 02:20:24.367246 | TASK [add-build-sshkey : Enable access via build key on all nodes] 2026-04-22 02:20:24.918844 | controller | changed 2026-04-22 02:20:24.927988 | 2026-04-22 02:20:24.928184 | TASK [add-build-sshkey : Make sure user has a .ssh] 2026-04-22 02:20:25.145210 | controller | ok 2026-04-22 02:20:25.158076 | 2026-04-22 02:20:25.158177 | TASK [add-build-sshkey : Install build private key as SSH key on all nodes] 2026-04-22 02:20:25.695131 | controller | changed 2026-04-22 02:20:25.699891 | 2026-04-22 02:20:25.699958 | TASK [add-build-sshkey : Install build public key as SSH key on all nodes] 2026-04-22 02:20:26.225223 | controller | changed 2026-04-22 02:20:26.231351 | 2026-04-22 02:20:26.231425 | TASK [add-build-sshkey : Remote setup ssh keys (windows)] 2026-04-22 02:20:26.276732 | controller | skipping: Conditional result was False 2026-04-22 02:20:26.283089 | 2026-04-22 02:20:26.283193 | TASK [remove-zuul-sshkey : Remove master key from local agent] 2026-04-22 02:20:26.813532 | controller -> localhost | changed 2026-04-22 02:20:26.822484 | 2026-04-22 02:20:26.822559 | TASK [add-build-sshkey : Add back temp key] 2026-04-22 02:20:27.219826 | controller -> localhost | Identity added: /var/lib/zuul/builds/2d53591f7af84d9a8fcdd1055f1f722a/work/2d53591f7af84d9a8fcdd1055f1f722a_id_rsa (zuul-build-sshkey) 2026-04-22 02:20:27.220065 | controller -> localhost | ok: Runtime: 0:00:00.011381 2026-04-22 02:20:27.225528 | 2026-04-22 02:20:27.225593 | TASK [add-build-sshkey : Verify we can still SSH to all nodes] 2026-04-22 02:20:27.596540 | controller | ok 2026-04-22 02:20:27.647792 | 2026-04-22 02:20:27.647911 | TASK [add-build-sshkey : Verify we can still SSH to all nodes (windows)] 2026-04-22 02:20:27.673265 | controller | skipping: Conditional result was False 2026-04-22 02:20:27.687072 | 2026-04-22 02:20:27.687229 | TASK [prepare-workspace : Start zuul_console daemon.] 2026-04-22 02:20:28.031169 | controller | ok 2026-04-22 02:20:28.098085 | 2026-04-22 02:20:28.098217 | TASK [prepare-workspace : Synchronize src repos to workspace directory.] 2026-04-22 02:20:29.420595 | controller | Output suppressed because no_log was given 2026-04-22 02:20:29.576808 | 2026-04-22 02:20:29.576979 | LOOP [ensure-output-dirs : Empty Zuul Output directories by removing them] 2026-04-22 02:20:29.815738 | controller | ok: "logs" 2026-04-22 02:20:29.816044 | controller | ok: All items complete 2026-04-22 02:20:29.816084 | 2026-04-22 02:20:29.994951 | controller | ok: "artifacts" 2026-04-22 02:20:30.188630 | controller | ok: "docs" 2026-04-22 02:20:30.196018 | 2026-04-22 02:20:30.196092 | LOOP [ensure-output-dirs : Ensure Zuul Output directories exist] 2026-04-22 02:20:30.396609 | controller | changed: "logs" 2026-04-22 02:20:30.583725 | controller | changed: "artifacts" 2026-04-22 02:20:30.754569 | controller | changed: "docs" 2026-04-22 02:20:30.784419 | 2026-04-22 02:20:30.784540 | PLAY RECAP 2026-04-22 02:20:30.784604 | controller | ok: 15 changed: 8 unreachable: 0 failed: 0 skipped: 3 rescued: 0 ignored: 0 2026-04-22 02:20:30.784658 | localhost | ok: 6 changed: 2 unreachable: 0 failed: 0 skipped: 0 rescued: 0 ignored: 0 2026-04-22 02:20:30.784687 | 2026-04-22 02:20:30.929587 | PRE-RUN END RESULT_NORMAL: [trusted : github.com/vexxhost/zuul-config/playbooks/base/pre.yaml@main] 2026-04-22 02:20:30.955083 | PRE-RUN START: [untrusted : github.com/vexxhost/zuul-jobs/playbooks/molecule/pre.yaml@main] 2026-04-22 02:20:31.522365 | 2026-04-22 02:20:31.522517 | PLAY [all] 2026-04-22 02:20:31.542905 | 2026-04-22 02:20:31.543492 | TASK [setup-uv : Extract archive] 2026-04-22 02:20:33.954025 | controller | changed 2026-04-22 02:20:33.959791 | 2026-04-22 02:20:33.959867 | TASK [setup-uv : Print version] 2026-04-22 02:20:34.497870 | controller | uv 0.8.13 2026-04-22 02:20:35.033887 | controller | ok: Runtime: 0:00:00.016179 2026-04-22 02:20:35.041289 | 2026-04-22 02:20:35.041359 | PLAY RECAP 2026-04-22 02:20:35.041426 | controller | ok: 2 changed: 2 unreachable: 0 failed: 0 skipped: 0 rescued: 0 ignored: 0 2026-04-22 02:20:35.041460 | 2026-04-22 02:20:35.206091 | PRE-RUN END RESULT_NORMAL: [untrusted : github.com/vexxhost/zuul-jobs/playbooks/molecule/pre.yaml@main] 2026-04-22 02:20:35.213549 | PRE-RUN START: [untrusted : github.com/vexxhost/ansible-collection-kubernetes/test-playbooks/molecule/pre.yml@main] 2026-04-22 02:20:35.827670 | 2026-04-22 02:20:35.827804 | PLAY [all] 2026-04-22 02:20:35.838047 | 2026-04-22 02:20:35.838120 | TASK [Update apt cache] 2026-04-22 02:20:40.735348 | controller | ok 2026-04-22 02:20:40.741214 | 2026-04-22 02:20:40.741292 | TASK [Disable firewalld] 2026-04-22 02:20:40.765047 | controller | skipping: Conditional result was False 2026-04-22 02:20:40.773505 | 2026-04-22 02:20:40.773584 | TASK [Install "jq" for log collection] 2026-04-22 02:20:43.027307 | controller | changed 2026-04-22 02:20:43.029449 | 2026-04-22 02:20:43.029501 | PLAY RECAP 2026-04-22 02:20:43.029547 | controller | ok: 2 changed: 1 unreachable: 0 failed: 0 skipped: 1 rescued: 0 ignored: 0 2026-04-22 02:20:43.029569 | 2026-04-22 02:20:43.139156 | PRE-RUN END RESULT_NORMAL: [untrusted : github.com/vexxhost/ansible-collection-kubernetes/test-playbooks/molecule/pre.yml@main] 2026-04-22 02:20:43.140572 | RUN START: [untrusted : github.com/vexxhost/zuul-jobs/playbooks/molecule/run.yaml@main] 2026-04-22 02:20:43.820593 | 2026-04-22 02:20:43.820813 | PLAY [all] 2026-04-22 02:20:43.833069 | 2026-04-22 02:20:43.833166 | TASK [Copy inventory file for Zuul] 2026-04-22 02:20:44.860455 | controller | changed 2026-04-22 02:20:45.011653 | 2026-04-22 02:20:45.011838 | TASK [Switch "ansible_host" to private IP] 2026-04-22 02:20:45.324983 | controller | changed: 1 replacements made 2026-04-22 02:20:45.329636 | 2026-04-22 02:20:45.329708 | TASK [Run Molecule scenario] 2026-04-22 02:20:45.781260 | controller | Using CPython 3.13.5 interpreter at: /usr/bin/python3 2026-04-22 02:20:45.781344 | controller | Creating virtual environment at: .venv 2026-04-22 02:20:46.127597 | controller | Downloading pygments (1.2MiB) 2026-04-22 02:20:46.127841 | controller | Downloading cryptography (4.3MiB) 2026-04-22 02:20:46.128660 | controller | Downloading ansible-core (2.3MiB) 2026-04-22 02:20:46.282173 | controller | Downloading cryptography 2026-04-22 02:20:46.336271 | controller | Downloading pygments 2026-04-22 02:20:46.530472 | controller | Downloading ansible-core 2026-04-22 02:20:46.580298 | controller | Installed 36 packages in 49ms 2026-04-22 02:20:47.241807 | controller | INFO Collection 'vexxhost.kubernetes' detected. 2026-04-22 02:20:47.241888 | controller | INFO Scenarios will be used from 'extensions/molecule' 2026-04-22 02:20:48.099382 | controller | CRITICAL 'extensions/molecule/default/molecule.yml' glob failed. Exiting. 2026-04-22 02:20:48.099444 | controller | INFO default scenario not found, disabling shared state. 2026-04-22 02:20:48.099463 | controller | INFO [upload-helm-chart > discovery] scenario test matrix: dependency, cleanup, destroy, syntax, create, prepare, converge, idempotence, side_effect, verify, cleanup, destroy 2026-04-22 02:20:48.099561 | controller | INFO [upload-helm-chart > prerun] Performing prerun with role_name_check=0... 2026-04-22 02:21:05.969032 | controller | INFO [upload-helm-chart > dependency] Executing 2026-04-22 02:21:05.969244 | controller | WARNING [upload-helm-chart > dependency] Missing roles requirements file: requirements.yml 2026-04-22 02:21:05.969438 | controller | WARNING [upload-helm-chart > dependency] Missing collections requirements file: collections.yml 2026-04-22 02:21:05.969553 | controller | WARNING [upload-helm-chart > dependency] Executed: 2 missing (Remove from test_sequence to suppress) 2026-04-22 02:21:05.974941 | controller | INFO [upload-helm-chart > cleanup] Executing 2026-04-22 02:21:05.975273 | controller | WARNING [upload-helm-chart > cleanup] Executed: Missing playbook (Remove from test_sequence to suppress) 2026-04-22 02:21:05.980518 | controller | INFO [upload-helm-chart > destroy] Executing 2026-04-22 02:21:05.980577 | controller | WARNING [upload-helm-chart > destroy] Skipping, '--destroy=never' requested. 2026-04-22 02:21:05.980639 | controller | INFO [upload-helm-chart > destroy] Executed: Successful 2026-04-22 02:21:05.985882 | controller | INFO [upload-helm-chart > syntax] Executing 2026-04-22 02:21:06.859341 | controller | 2026-04-22 02:21:06.859582 | controller | playbook: /home/zuul/src/github.com/vexxhost/ansible-collection-kubernetes/extensions/molecule/upload-helm-chart/converge.yml 2026-04-22 02:21:06.937935 | controller | INFO [upload-helm-chart > syntax] Executed: Successful 2026-04-22 02:21:06.949034 | controller | INFO [upload-helm-chart > create] Executing 2026-04-22 02:21:06.950519 | controller | WARNING [upload-helm-chart > create] Executed: Missing playbook (Remove from test_sequence to suppress) 2026-04-22 02:21:06.955991 | controller | INFO [upload-helm-chart > prepare] Executing 2026-04-22 02:21:06.956288 | controller | WARNING [upload-helm-chart > prepare] Executed: Missing playbook (Remove from test_sequence to suppress) 2026-04-22 02:21:06.961529 | controller | INFO [upload-helm-chart > converge] Executing 2026-04-22 02:21:07.869253 | controller | 2026-04-22 02:21:07.869359 | controller | PLAY [Converge] **************************************************************** 2026-04-22 02:21:07.869608 | controller | 2026-04-22 02:21:07.869865 | controller | TASK [Gathering Facts] ********************************************************* 2026-04-22 02:21:07.870118 | controller | Wednesday 22 April 2026 02:21:07 +0000 (0:00:00.033) 0:00:00.033 ******* 2026-04-22 02:21:09.210820 | controller | [WARNING]: Host 'controller' is using the discovered Python interpreter at '/usr/bin/python3.13', but future installation of another Python interpreter could cause a different interpreter to be discovered. See https://docs.ansible.com/ansible-core/2.20/reference_appendices/interpreter_discovery.html for more information. 2026-04-22 02:21:09.215075 | controller | ok: [controller] 2026-04-22 02:21:09.215092 | controller | 2026-04-22 02:21:09.215096 | controller | TASK [vexxhost.kubernetes.upload_helm_chart : Include help chart upload method tasks] *** 2026-04-22 02:21:09.215100 | controller | Wednesday 22 April 2026 02:21:09 +0000 (0:00:01.346) 0:00:01.379 ******* 2026-04-22 02:21:09.298275 | controller | included: /home/zuul/.ansible/collections/ansible_collections/vexxhost/kubernetes/roles/upload_helm_chart/tasks/synchronize.yml for controller 2026-04-22 02:21:09.298569 | controller | 2026-04-22 02:21:09.298822 | controller | TASK [vexxhost.kubernetes.upload_helm_chart : Upload Helm chart] *************** 2026-04-22 02:21:09.299070 | controller | Wednesday 22 April 2026 02:21:09 +0000 (0:00:00.083) 0:00:01.462 ******* 2026-04-22 02:21:10.046262 | controller | changed: [controller] 2026-04-22 02:21:10.046306 | controller | 2026-04-22 02:21:10.046312 | controller | TASK [vexxhost.kubernetes.upload_helm_chart : Include help chart upload method tasks] *** 2026-04-22 02:21:10.048510 | controller | Wednesday 22 April 2026 02:21:10 +0000 (0:00:00.746) 0:00:02.209 ******* 2026-04-22 02:21:10.093578 | controller | included: /home/zuul/.ansible/collections/ansible_collections/vexxhost/kubernetes/roles/upload_helm_chart/tasks/copy.yml for controller 2026-04-22 02:21:10.093606 | controller | 2026-04-22 02:21:10.093732 | controller | TASK [vexxhost.kubernetes.upload_helm_chart : Ensure destination dir] ********** 2026-04-22 02:21:10.093824 | controller | Wednesday 22 April 2026 02:21:10 +0000 (0:00:00.048) 0:00:02.258 ******* 2026-04-22 02:21:10.517777 | controller | changed: [controller] 2026-04-22 02:21:10.517939 | controller | 2026-04-22 02:21:10.518201 | controller | TASK [vexxhost.kubernetes.upload_helm_chart : Upload helm chart with multi_copy] *** 2026-04-22 02:21:10.518390 | controller | Wednesday 22 April 2026 02:21:10 +0000 (0:00:00.423) 0:00:02.682 ******* 2026-04-22 02:21:11.687208 | controller | changed: [controller] 2026-04-22 02:21:11.687365 | controller | 2026-04-22 02:21:11.687572 | controller | TASK [vexxhost.kubernetes.upload_helm_chart : Find destination files] ********** 2026-04-22 02:21:11.687761 | controller | Wednesday 22 April 2026 02:21:11 +0000 (0:00:01.169) 0:00:03.851 ******* 2026-04-22 02:21:12.097205 | controller | ok: [controller] 2026-04-22 02:21:12.097239 | controller | 2026-04-22 02:21:12.097245 | controller | TASK [vexxhost.kubernetes.upload_helm_chart : Delete any destination files not in the sources] *** 2026-04-22 02:21:12.097249 | controller | Wednesday 22 April 2026 02:21:12 +0000 (0:00:00.407) 0:00:04.258 ******* 2026-04-22 02:21:12.150630 | controller | skipping: [controller] 2026-04-22 02:21:12.150642 | controller | 2026-04-22 02:21:12.150646 | controller | PLAY RECAP ********************************************************************* 2026-04-22 02:21:12.150652 | controller | controller : ok=7 changed=3 unreachable=0 failed=0 skipped=1 rescued=0 ignored=0 2026-04-22 02:21:12.150655 | controller | 2026-04-22 02:21:12.150659 | controller | 2026-04-22 02:21:12.150662 | controller | TASKS RECAP ******************************************************************** 2026-04-22 02:21:12.150665 | controller | Wednesday 22 April 2026 02:21:12 +0000 (0:00:00.056) 0:00:04.315 ******* 2026-04-22 02:21:12.150669 | controller | =============================================================================== 2026-04-22 02:21:12.150672 | controller | Gathering Facts --------------------------------------------------------- 1.35s 2026-04-22 02:21:12.150676 | controller | vexxhost.kubernetes.upload_helm_chart : Upload helm chart with multi_copy --- 1.17s 2026-04-22 02:21:12.150679 | controller | vexxhost.kubernetes.upload_helm_chart : Upload Helm chart --------------- 0.75s 2026-04-22 02:21:12.150690 | controller | vexxhost.kubernetes.upload_helm_chart : Ensure destination dir ---------- 0.42s 2026-04-22 02:21:12.150694 | controller | vexxhost.kubernetes.upload_helm_chart : Find destination files ---------- 0.41s 2026-04-22 02:21:12.150697 | controller | vexxhost.kubernetes.upload_helm_chart : Include help chart upload method tasks --- 0.08s 2026-04-22 02:21:12.150701 | controller | vexxhost.kubernetes.upload_helm_chart : Delete any destination files not in the sources --- 0.06s 2026-04-22 02:21:12.150704 | controller | vexxhost.kubernetes.upload_helm_chart : Include help chart upload method tasks --- 0.05s 2026-04-22 02:21:12.295465 | controller | INFO [upload-helm-chart > converge] Executed: Successful 2026-04-22 02:21:12.301468 | controller | INFO [upload-helm-chart > idempotence] Executing 2026-04-22 02:21:13.116947 | controller | 2026-04-22 02:21:13.117316 | controller | PLAY [Converge] **************************************************************** 2026-04-22 02:21:13.117554 | controller | 2026-04-22 02:21:13.117805 | controller | TASK [Gathering Facts] ********************************************************* 2026-04-22 02:21:13.118088 | controller | Wednesday 22 April 2026 02:21:13 +0000 (0:00:00.010) 0:00:00.010 ******* 2026-04-22 02:21:14.232076 | controller | [WARNING]: Host 'controller' is using the discovered Python interpreter at '/usr/bin/python3.13', but future installation of another Python interpreter could cause a different interpreter to be discovered. See https://docs.ansible.com/ansible-core/2.20/reference_appendices/interpreter_discovery.html for more information. 2026-04-22 02:21:14.239643 | controller | ok: [controller] 2026-04-22 02:21:14.239898 | controller | 2026-04-22 02:21:14.240204 | controller | TASK [vexxhost.kubernetes.upload_helm_chart : Include help chart upload method tasks] *** 2026-04-22 02:21:14.240464 | controller | Wednesday 22 April 2026 02:21:14 +0000 (0:00:01.122) 0:00:01.133 ******* 2026-04-22 02:21:14.319742 | controller | included: /home/zuul/.ansible/collections/ansible_collections/vexxhost/kubernetes/roles/upload_helm_chart/tasks/synchronize.yml for controller 2026-04-22 02:21:14.320009 | controller | 2026-04-22 02:21:14.320335 | controller | TASK [vexxhost.kubernetes.upload_helm_chart : Upload Helm chart] *************** 2026-04-22 02:21:14.320602 | controller | Wednesday 22 April 2026 02:21:14 +0000 (0:00:00.080) 0:00:01.213 ******* 2026-04-22 02:21:15.077156 | controller | ok: [controller] 2026-04-22 02:21:15.077448 | controller | 2026-04-22 02:21:15.077729 | controller | TASK [vexxhost.kubernetes.upload_helm_chart : Include help chart upload method tasks] *** 2026-04-22 02:21:15.077990 | controller | Wednesday 22 April 2026 02:21:15 +0000 (0:00:00.756) 0:00:01.970 ******* 2026-04-22 02:21:15.114493 | controller | included: /home/zuul/.ansible/collections/ansible_collections/vexxhost/kubernetes/roles/upload_helm_chart/tasks/copy.yml for controller 2026-04-22 02:21:15.114747 | controller | 2026-04-22 02:21:15.115017 | controller | TASK [vexxhost.kubernetes.upload_helm_chart : Ensure destination dir] ********** 2026-04-22 02:21:15.115265 | controller | Wednesday 22 April 2026 02:21:15 +0000 (0:00:00.037) 0:00:02.008 ******* 2026-04-22 02:21:15.538976 | controller | ok: [controller] 2026-04-22 02:21:15.539130 | controller | 2026-04-22 02:21:15.539265 | controller | TASK [vexxhost.kubernetes.upload_helm_chart : Upload helm chart with multi_copy] *** 2026-04-22 02:21:15.539390 | controller | Wednesday 22 April 2026 02:21:15 +0000 (0:00:00.423) 0:00:02.432 ******* 2026-04-22 02:21:16.650599 | controller | ok: [controller] 2026-04-22 02:21:16.651317 | controller | 2026-04-22 02:21:16.651335 | controller | TASK [vexxhost.kubernetes.upload_helm_chart : Find destination files] ********** 2026-04-22 02:21:16.651344 | controller | Wednesday 22 April 2026 02:21:16 +0000 (0:00:01.110) 0:00:03.542 ******* 2026-04-22 02:21:17.053171 | controller | ok: [controller] 2026-04-22 02:21:17.053190 | controller | 2026-04-22 02:21:17.053196 | controller | TASK [vexxhost.kubernetes.upload_helm_chart : Delete any destination files not in the sources] *** 2026-04-22 02:21:17.053201 | controller | Wednesday 22 April 2026 02:21:17 +0000 (0:00:00.401) 0:00:03.944 ******* 2026-04-22 02:21:17.097850 | controller | skipping: [controller] 2026-04-22 02:21:17.098039 | controller | 2026-04-22 02:21:17.098237 | controller | PLAY RECAP ********************************************************************* 2026-04-22 02:21:17.098449 | controller | controller : ok=7 changed=0 unreachable=0 failed=0 skipped=1 rescued=0 ignored=0 2026-04-22 02:21:17.098624 | controller | 2026-04-22 02:21:17.098796 | controller | 2026-04-22 02:21:17.098986 | controller | TASKS RECAP ******************************************************************** 2026-04-22 02:21:17.099184 | controller | Wednesday 22 April 2026 02:21:17 +0000 (0:00:00.046) 0:00:03.990 ******* 2026-04-22 02:21:17.099367 | controller | =============================================================================== 2026-04-22 02:21:17.099554 | controller | Gathering Facts --------------------------------------------------------- 1.12s 2026-04-22 02:21:17.099755 | controller | vexxhost.kubernetes.upload_helm_chart : Upload helm chart with multi_copy --- 1.11s 2026-04-22 02:21:17.099958 | controller | vexxhost.kubernetes.upload_helm_chart : Upload Helm chart --------------- 0.76s 2026-04-22 02:21:17.100150 | controller | vexxhost.kubernetes.upload_helm_chart : Ensure destination dir ---------- 0.42s 2026-04-22 02:21:17.100369 | controller | vexxhost.kubernetes.upload_helm_chart : Find destination files ---------- 0.40s 2026-04-22 02:21:17.100568 | controller | vexxhost.kubernetes.upload_helm_chart : Include help chart upload method tasks --- 0.08s 2026-04-22 02:21:17.100770 | controller | vexxhost.kubernetes.upload_helm_chart : Delete any destination files not in the sources --- 0.05s 2026-04-22 02:21:17.100975 | controller | vexxhost.kubernetes.upload_helm_chart : Include help chart upload method tasks --- 0.04s 2026-04-22 02:21:17.214598 | controller | INFO [upload-helm-chart > idempotence] Executed: Successful 2026-04-22 02:21:17.226473 | controller | INFO [upload-helm-chart > side_effect] Executing 2026-04-22 02:21:18.067831 | controller | 2026-04-22 02:21:18.067997 | controller | PLAY [Side effect] ************************************************************* 2026-04-22 02:21:18.068164 | controller | 2026-04-22 02:21:18.068386 | controller | TASK [Gathering Facts] ********************************************************* 2026-04-22 02:21:18.068782 | controller | Wednesday 22 April 2026 02:21:18 +0000 (0:00:00.010) 0:00:00.010 ******* 2026-04-22 02:21:20.167983 | controller | [WARNING]: Host 'controller' is using the discovered Python interpreter at '/usr/bin/python3.13', but future installation of another Python interpreter could cause a different interpreter to be discovered. See https://docs.ansible.com/ansible-core/2.20/reference_appendices/interpreter_discovery.html for more information. 2026-04-22 02:21:20.175859 | controller | ok: [controller] 2026-04-22 02:21:20.176049 | controller | 2026-04-22 02:21:20.176224 | controller | TASK [vexxhost.kubernetes.upload_helm_chart : Include help chart upload method tasks] *** 2026-04-22 02:21:20.176416 | controller | Wednesday 22 April 2026 02:21:20 +0000 (0:00:02.108) 0:00:02.118 ******* 2026-04-22 02:21:20.251152 | controller | included: /home/zuul/.ansible/collections/ansible_collections/vexxhost/kubernetes/roles/upload_helm_chart/tasks/synchronize.yml for controller 2026-04-22 02:21:20.251268 | controller | 2026-04-22 02:21:20.251518 | controller | TASK [vexxhost.kubernetes.upload_helm_chart : Upload Helm chart] *************** 2026-04-22 02:21:20.251670 | controller | Wednesday 22 April 2026 02:21:20 +0000 (0:00:00.075) 0:00:02.194 ******* 2026-04-22 02:21:21.003469 | controller | changed: [controller] 2026-04-22 02:21:21.003539 | controller | 2026-04-22 02:21:21.003786 | controller | TASK [vexxhost.kubernetes.upload_helm_chart : Include help chart upload method tasks] *** 2026-04-22 02:21:21.003981 | controller | Wednesday 22 April 2026 02:21:20 +0000 (0:00:00.751) 0:00:02.945 ******* 2026-04-22 02:21:21.050119 | controller | included: /home/zuul/.ansible/collections/ansible_collections/vexxhost/kubernetes/roles/upload_helm_chart/tasks/copy.yml for controller 2026-04-22 02:21:21.050317 | controller | 2026-04-22 02:21:21.050484 | controller | TASK [vexxhost.kubernetes.upload_helm_chart : Ensure destination dir] ********** 2026-04-22 02:21:21.050683 | controller | Wednesday 22 April 2026 02:21:21 +0000 (0:00:00.047) 0:00:02.993 ******* 2026-04-22 02:21:21.464935 | controller | ok: [controller] 2026-04-22 02:21:21.464986 | controller | 2026-04-22 02:21:21.464995 | controller | TASK [vexxhost.kubernetes.upload_helm_chart : Upload helm chart with multi_copy] *** 2026-04-22 02:21:21.465004 | controller | Wednesday 22 April 2026 02:21:21 +0000 (0:00:00.413) 0:00:03.406 ******* 2026-04-22 02:21:22.561737 | controller | ok: [controller] 2026-04-22 02:21:22.561816 | controller | 2026-04-22 02:21:22.561830 | controller | TASK [vexxhost.kubernetes.upload_helm_chart : Find destination files] ********** 2026-04-22 02:21:22.561929 | controller | Wednesday 22 April 2026 02:21:22 +0000 (0:00:01.094) 0:00:04.501 ******* 2026-04-22 02:21:22.976003 | controller | ok: [controller] 2026-04-22 02:21:22.976071 | controller | 2026-04-22 02:21:22.976158 | controller | TASK [vexxhost.kubernetes.upload_helm_chart : Delete any destination files not in the sources] *** 2026-04-22 02:21:22.976281 | controller | Wednesday 22 April 2026 02:21:22 +0000 (0:00:00.417) 0:00:04.918 ******* 2026-04-22 02:21:23.303247 | controller | changed: [controller] => (item=/file) 2026-04-22 02:21:23.303296 | controller | 2026-04-22 02:21:23.303303 | controller | PLAY RECAP ********************************************************************* 2026-04-22 02:21:23.303310 | controller | controller : ok=8 changed=2 unreachable=0 failed=0 skipped=0 rescued=0 ignored=0 2026-04-22 02:21:23.303314 | controller | 2026-04-22 02:21:23.303319 | controller | 2026-04-22 02:21:23.303324 | controller | TASKS RECAP ******************************************************************** 2026-04-22 02:21:23.303344 | controller | Wednesday 22 April 2026 02:21:23 +0000 (0:00:00.324) 0:00:05.243 ******* 2026-04-22 02:21:23.303349 | controller | =============================================================================== 2026-04-22 02:21:23.303353 | controller | Gathering Facts --------------------------------------------------------- 2.11s 2026-04-22 02:21:23.303358 | controller | vexxhost.kubernetes.upload_helm_chart : Upload helm chart with multi_copy --- 1.09s 2026-04-22 02:21:23.303363 | controller | vexxhost.kubernetes.upload_helm_chart : Upload Helm chart --------------- 0.75s 2026-04-22 02:21:23.303367 | controller | vexxhost.kubernetes.upload_helm_chart : Find destination files ---------- 0.42s 2026-04-22 02:21:23.303372 | controller | vexxhost.kubernetes.upload_helm_chart : Ensure destination dir ---------- 0.41s 2026-04-22 02:21:23.303378 | controller | vexxhost.kubernetes.upload_helm_chart : Delete any destination files not in the sources --- 0.32s 2026-04-22 02:21:23.303383 | controller | vexxhost.kubernetes.upload_helm_chart : Include help chart upload method tasks --- 0.08s 2026-04-22 02:21:23.303387 | controller | vexxhost.kubernetes.upload_helm_chart : Include help chart upload method tasks --- 0.05s 2026-04-22 02:21:23.405020 | controller | INFO [upload-helm-chart > side_effect] Executed: Successful 2026-04-22 02:21:23.416354 | controller | INFO [upload-helm-chart > verify] Executing 2026-04-22 02:21:24.255082 | controller | 2026-04-22 02:21:24.255435 | controller | PLAY [Verify] ****************************************************************** 2026-04-22 02:21:24.255687 | controller | 2026-04-22 02:21:24.255972 | controller | TASK [Gathering Facts] ********************************************************* 2026-04-22 02:21:24.256238 | controller | Wednesday 22 April 2026 02:21:24 +0000 (0:00:00.010) 0:00:00.010 ******* 2026-04-22 02:21:25.319805 | controller | [WARNING]: Host 'controller' is using the discovered Python interpreter at '/usr/bin/python3.13', but future installation of another Python interpreter could cause a different interpreter to be discovered. See https://docs.ansible.com/ansible-core/2.20/reference_appendices/interpreter_discovery.html for more information. 2026-04-22 02:21:25.325240 | controller | ok: [controller] 2026-04-22 02:21:25.325496 | controller | 2026-04-22 02:21:25.325749 | controller | TASK [Stat file 1] ************************************************************* 2026-04-22 02:21:25.326032 | controller | Wednesday 22 April 2026 02:21:25 +0000 (0:00:01.070) 0:00:01.081 ******* 2026-04-22 02:21:25.730399 | controller | ok: [controller] 2026-04-22 02:21:25.730685 | controller | 2026-04-22 02:21:25.730941 | controller | TASK [Stat file 2] ************************************************************* 2026-04-22 02:21:25.731193 | controller | Wednesday 22 April 2026 02:21:25 +0000 (0:00:00.404) 0:00:01.485 ******* 2026-04-22 02:21:26.032283 | controller | ok: [controller] 2026-04-22 02:21:26.032578 | controller | 2026-04-22 02:21:26.032849 | controller | TASK [Stat removed file 1] ***************************************************** 2026-04-22 02:21:26.033116 | controller | Wednesday 22 April 2026 02:21:26 +0000 (0:00:00.302) 0:00:01.787 ******* 2026-04-22 02:21:26.324975 | controller | ok: [controller] 2026-04-22 02:21:26.324988 | controller | 2026-04-22 02:21:26.324992 | controller | TASK [Stat removed file 2] ***************************************************** 2026-04-22 02:21:26.325005 | controller | Wednesday 22 April 2026 02:21:26 +0000 (0:00:00.288) 0:00:02.076 ******* 2026-04-22 02:21:26.610717 | controller | ok: [controller] 2026-04-22 02:21:26.610796 | controller | 2026-04-22 02:21:26.610898 | controller | TASK [ansible.builtin.assert] ************************************************** 2026-04-22 02:21:26.611021 | controller | Wednesday 22 April 2026 02:21:26 +0000 (0:00:00.289) 0:00:02.366 ******* 2026-04-22 02:21:26.647295 | controller | ok: [controller] => { 2026-04-22 02:21:26.647454 | controller | "changed": false, 2026-04-22 02:21:26.649254 | controller | "msg": "All assertions passed" 2026-04-22 02:21:26.649301 | controller | } 2026-04-22 02:21:26.649311 | controller | 2026-04-22 02:21:26.649320 | controller | PLAY RECAP ********************************************************************* 2026-04-22 02:21:26.649329 | controller | controller : ok=6 changed=0 unreachable=0 failed=0 skipped=0 rescued=0 ignored=0 2026-04-22 02:21:26.649337 | controller | 2026-04-22 02:21:26.649361 | controller | 2026-04-22 02:21:26.649368 | controller | TASKS RECAP ******************************************************************** 2026-04-22 02:21:26.649377 | controller | Wednesday 22 April 2026 02:21:26 +0000 (0:00:00.037) 0:00:02.403 ******* 2026-04-22 02:21:26.649392 | controller | =============================================================================== 2026-04-22 02:21:26.650397 | controller | Gathering Facts --------------------------------------------------------- 1.07s 2026-04-22 02:21:26.650437 | controller | Stat file 1 ------------------------------------------------------------- 0.40s 2026-04-22 02:21:26.650445 | controller | Stat file 2 ------------------------------------------------------------- 0.30s 2026-04-22 02:21:26.650453 | controller | Stat removed file 2 ----------------------------------------------------- 0.29s 2026-04-22 02:21:26.650460 | controller | Stat removed file 1 ----------------------------------------------------- 0.29s 2026-04-22 02:21:26.650467 | controller | ansible.builtin.assert -------------------------------------------------- 0.04s 2026-04-22 02:21:26.775733 | controller | INFO [upload-helm-chart > verify] Executed: Successful 2026-04-22 02:21:26.787006 | controller | INFO [upload-helm-chart > cleanup] Executing 2026-04-22 02:21:26.787426 | controller | WARNING [upload-helm-chart > cleanup] Executed: Missing playbook (Remove from test_sequence to suppress) 2026-04-22 02:21:26.792880 | controller | INFO [upload-helm-chart > destroy] Executing 2026-04-22 02:21:26.792976 | controller | WARNING [upload-helm-chart > destroy] Skipping, '--destroy=never' requested. 2026-04-22 02:21:26.793063 | controller | INFO [upload-helm-chart > destroy] Executed: Successful 2026-04-22 02:21:26.793407 | controller | WARNING Molecule executed 1 scenario (1 missing files) 2026-04-22 02:21:26.914601 | controller | ok: Runtime: 0:00:41.166257 2026-04-22 02:21:26.917947 | 2026-04-22 02:21:26.917996 | PLAY RECAP 2026-04-22 02:21:26.918042 | controller | ok: 3 changed: 3 unreachable: 0 failed: 0 skipped: 0 rescued: 0 ignored: 0 2026-04-22 02:21:26.918064 | 2026-04-22 02:21:27.054818 | RUN END RESULT_NORMAL: [untrusted : github.com/vexxhost/zuul-jobs/playbooks/molecule/run.yaml@main] 2026-04-22 02:21:27.057719 | POST-RUN START: [untrusted : github.com/vexxhost/ansible-collection-kubernetes/test-playbooks/molecule/post.yml@main] 2026-04-22 02:21:27.607909 | 2026-04-22 02:21:27.608035 | PLAY [all] 2026-04-22 02:21:27.618511 | 2026-04-22 02:21:27.618591 | TASK [describe-kubernetes-objects : creating directory for cluster scoped objects] 2026-04-22 02:21:27.987750 | controller | changed 2026-04-22 02:21:27.993318 | 2026-04-22 02:21:27.993405 | TASK [describe-kubernetes-objects : Gathering descriptions for cluster scoped objects] 2026-04-22 02:21:28.384750 | controller | xargs: warning: options --max-args and --replace/-I/-i are mutually exclusive, ignoring previous --max-args value 2026-04-22 02:21:28.384870 | controller | xargs: warning: options --max-args and --replace/-I/-i are mutually exclusive, ignoring previous --max-args value 2026-04-22 02:21:28.392640 | controller | environment: line 1: kubectl: command not found 2026-04-22 02:21:28.394800 | controller | environment: line 1: kubectl: command not found 2026-04-22 02:21:28.394925 | controller | xargs: warning: options --max-lines and --replace/-I/-i are mutually exclusive, ignoring previous --max-lines value 2026-04-22 02:21:28.397742 | controller | xargs: warning: options --max-lines and --replace/-I/-i are mutually exclusive, ignoring previous --max-lines value 2026-04-22 02:21:28.399448 | controller | environment: line 1: kubectl: command not found 2026-04-22 02:21:28.401081 | controller | xargs: warning: options --max-lines and --replace/-I/-i are mutually exclusive, ignoring previous --max-lines value 2026-04-22 02:21:28.401937 | controller | environment: line 1: kubectl: command not found 2026-04-22 02:21:28.403447 | controller | xargs: warning: options --max-lines and --replace/-I/-i are mutually exclusive, ignoring previous --max-lines value 2026-04-22 02:21:28.404548 | controller | environment: line 1: kubectl: command not found 2026-04-22 02:21:28.406265 | controller | xargs: warning: options --max-lines and --replace/-I/-i are mutually exclusive, ignoring previous --max-lines value 2026-04-22 02:21:28.522952 | controller | ok: Runtime: 0:00:00.037566 2026-04-22 02:21:28.529663 | 2026-04-22 02:21:28.529764 | TASK [describe-kubernetes-objects : creating directory for namespace scoped objects] 2026-04-22 02:21:28.764892 | controller | changed 2026-04-22 02:21:28.769779 | 2026-04-22 02:21:28.769852 | TASK [describe-kubernetes-objects : Gathering descriptions for namespace scoped objects] 2026-04-22 02:21:29.009979 | controller | environment: line 5: kubectl: command not found 2026-04-22 02:21:29.010897 | controller | xargs: warning: options --max-args and --replace/-I/-i are mutually exclusive, ignoring previous --max-args value 2026-04-22 02:21:29.011137 | controller | xargs: warning: options --max-args and --replace/-I/-i are mutually exclusive, ignoring previous --max-args value 2026-04-22 02:21:29.011428 | controller | xargs: warning: options --max-args and --replace/-I/-i are mutually exclusive, ignoring previous --max-args value 2026-04-22 02:21:29.299957 | controller | ok: Runtime: 0:00:00.012785 2026-04-22 02:21:29.307637 | 2026-04-22 02:21:29.307711 | TASK [describe-kubernetes-objects : Downloads logs to executor] 2026-04-22 02:21:30.000521 | controller | changed: 2026-04-22 02:21:30.000844 | controller | created directory /var/lib/zuul/builds/2d53591f7af84d9a8fcdd1055f1f722a/work/logs/controller 2026-04-22 02:21:30.000920 | controller | cd+++++++++ objects/ 2026-04-22 02:21:30.001008 | controller | cd+++++++++ objects/cluster/ 2026-04-22 02:21:30.001067 | controller | cd+++++++++ objects/namespaced/ 2026-04-22 02:21:30.020172 | 2026-04-22 02:21:30.020344 | TASK [gather-pod-logs : creating directory for pod logs] 2026-04-22 02:21:30.266096 | controller | changed 2026-04-22 02:21:30.270608 | 2026-04-22 02:21:30.270677 | TASK [gather-pod-logs : creating directory for failed pod logs] 2026-04-22 02:21:30.516617 | controller | changed 2026-04-22 02:21:30.522332 | 2026-04-22 02:21:30.522471 | TASK [gather-pod-logs : retrieve all kubernetes logs, current and previous (if they exist)] 2026-04-22 02:21:30.774956 | controller | environment: line 3: kubectl: command not found 2026-04-22 02:21:31.053654 | controller | ok: Runtime: 0:00:00.014810 2026-04-22 02:21:31.059982 | 2026-04-22 02:21:31.060098 | TASK [gather-pod-logs : Downloads pod logs to executor] 2026-04-22 02:21:31.599710 | controller | changed: 2026-04-22 02:21:31.599944 | controller | cd+++++++++ pod-logs/ 2026-04-22 02:21:31.599983 | controller | cd+++++++++ pod-logs/failed-pods/ 2026-04-22 02:21:31.609567 | 2026-04-22 02:21:31.609682 | LOOP [helm-release-status : creating directory for helm release status] 2026-04-22 02:21:31.854920 | controller | changed: "values" 2026-04-22 02:21:32.063755 | controller | changed: "releases" 2026-04-22 02:21:32.076348 | 2026-04-22 02:21:32.076519 | TASK [helm-release-status : Gather get release status for helm charts] 2026-04-22 02:21:32.336523 | controller | /bin/bash: line 3: kubectl: command not found 2026-04-22 02:21:32.606078 | controller | ok: Runtime: 0:00:00.009293 2026-04-22 02:21:32.611015 | 2026-04-22 02:21:32.611083 | TASK [helm-release-status : Downloads logs to executor] 2026-04-22 02:21:33.181908 | controller | changed: 2026-04-22 02:21:33.182140 | controller | cd+++++++++ helm/ 2026-04-22 02:21:33.182179 | controller | cd+++++++++ helm/releases/ 2026-04-22 02:21:33.182211 | controller | cd+++++++++ helm/values/ 2026-04-22 02:21:33.188624 | 2026-04-22 02:21:33.188695 | PLAY RECAP 2026-04-22 02:21:33.188762 | controller | ok: 12 changed: 12 unreachable: 0 failed: 0 skipped: 0 rescued: 0 ignored: 0 2026-04-22 02:21:33.188798 | 2026-04-22 02:21:33.326610 | POST-RUN END RESULT_NORMAL: [untrusted : github.com/vexxhost/ansible-collection-kubernetes/test-playbooks/molecule/post.yml@main] 2026-04-22 02:21:33.329423 | POST-RUN START: [trusted : github.com/vexxhost/zuul-config/playbooks/base/post.yaml@main] 2026-04-22 02:21:33.919498 | 2026-04-22 02:21:33.920073 | PLAY [all] 2026-04-22 02:21:33.930763 | 2026-04-22 02:21:33.930847 | TASK [fetch-output : Set log path for multiple nodes] 2026-04-22 02:21:33.976914 | controller | skipping: Conditional result was False 2026-04-22 02:21:33.985146 | 2026-04-22 02:21:33.985256 | TASK [fetch-output : Set log path for single node] 2026-04-22 02:21:34.026679 | controller | ok 2026-04-22 02:21:34.031593 | 2026-04-22 02:21:34.031687 | LOOP [fetch-output : Ensure local output dirs] 2026-04-22 02:21:34.430179 | controller -> localhost | ok: "/var/lib/zuul/builds/2d53591f7af84d9a8fcdd1055f1f722a/work/logs" 2026-04-22 02:21:34.639769 | controller -> localhost | changed: "/var/lib/zuul/builds/2d53591f7af84d9a8fcdd1055f1f722a/work/artifacts" 2026-04-22 02:21:34.840319 | controller -> localhost | changed: "/var/lib/zuul/builds/2d53591f7af84d9a8fcdd1055f1f722a/work/docs" 2026-04-22 02:21:34.855545 | 2026-04-22 02:21:34.855700 | LOOP [fetch-output : Collect logs, artifacts and docs] 2026-04-22 02:21:35.561596 | controller | changed: .d..t...... ./ 2026-04-22 02:21:35.561936 | controller | changed: All items complete 2026-04-22 02:21:35.561964 | 2026-04-22 02:21:36.059212 | controller | changed: .d..t...... ./ 2026-04-22 02:21:36.562706 | controller | changed: .d..t...... ./ 2026-04-22 02:21:36.584321 | 2026-04-22 02:21:36.584919 | LOOP [merge-output-to-logs : Move artifacts and docs to logs dir] 2026-04-22 02:21:37.008228 | controller -> localhost | ok: Item: artifacts Runtime: 0:00:00.007933 2026-04-22 02:21:37.221010 | controller -> localhost | ok: Item: docs Runtime: 0:00:00.007869 2026-04-22 02:21:37.238316 | 2026-04-22 02:21:37.238525 | PLAY [all] 2026-04-22 02:21:37.244709 | 2026-04-22 02:21:37.244782 | TASK [remove-build-sshkey : Remove the build SSH key from all nodes] 2026-04-22 02:21:37.731048 | controller | changed 2026-04-22 02:21:37.761837 | 2026-04-22 02:21:37.762006 | PLAY RECAP 2026-04-22 02:21:37.762068 | controller | ok: 5 changed: 4 unreachable: 0 failed: 0 skipped: 1 rescued: 0 ignored: 0 2026-04-22 02:21:37.762091 | 2026-04-22 02:21:37.901041 | POST-RUN END RESULT_NORMAL: [trusted : github.com/vexxhost/zuul-config/playbooks/base/post.yaml@main] 2026-04-22 02:21:37.902979 | POST-RUN START: [trusted : github.com/vexxhost/zuul-config/playbooks/base/post-logs.yaml@main] 2026-04-22 02:21:38.448253 | 2026-04-22 02:21:38.448378 | PLAY [localhost] 2026-04-22 02:21:38.458340 | 2026-04-22 02:21:38.458411 | TASK [Generate Zuul manifest] 2026-04-22 02:21:38.480110 | localhost | ok 2026-04-22 02:21:38.496998 | 2026-04-22 02:21:38.497076 | TASK [generate-zuul-manifest : Generate Zuul manifest] 2026-04-22 02:21:38.833588 | localhost | changed 2026-04-22 02:21:38.844874 | 2026-04-22 02:21:38.844947 | TASK [generate-zuul-manifest : Return Zuul manifest URL to Zuul] 2026-04-22 02:21:38.873385 | localhost | ok 2026-04-22 02:21:38.879881 | 2026-04-22 02:21:38.879948 | TASK [Upload logs] 2026-04-22 02:21:38.911729 | localhost | ok 2026-04-22 02:21:38.971927 | 2026-04-22 02:21:38.972065 | TASK [Set zuul-log-path fact] 2026-04-22 02:21:38.994904 | localhost | ok 2026-04-22 02:21:39.008854 | 2026-04-22 02:21:39.008924 | TASK [set-zuul-log-path-fact : Set log path for a build] 2026-04-22 02:21:39.041507 | localhost | ok 2026-04-22 02:21:39.049409 | 2026-04-22 02:21:39.049479 | TASK [upload-logs : Create log directories] 2026-04-22 02:21:39.474210 | localhost | changed 2026-04-22 02:21:39.479191 | 2026-04-22 02:21:39.479277 | TASK [upload-logs : Ensure logs are readable before uploading] 2026-04-22 02:21:39.895323 | localhost -> localhost | ok: Runtime: 0:00:00.005648 2026-04-22 02:21:39.903048 | 2026-04-22 02:21:39.903147 | TASK [upload-logs : Upload logs to log server] 2026-04-22 02:21:40.403238 | localhost | Output suppressed because no_log was given 2026-04-22 02:21:40.408482 | 2026-04-22 02:21:40.408572 | LOOP [upload-logs : Compress console log and json output] 2026-04-22 02:21:40.460254 | localhost | skipping: Conditional result was False 2026-04-22 02:21:40.467689 | localhost | skipping: Conditional result was False 2026-04-22 02:21:40.485250 | 2026-04-22 02:21:40.485441 | LOOP [upload-logs : Upload compressed console log and json output] 2026-04-22 02:21:40.531491 | localhost | skipping: Conditional result was False 2026-04-22 02:21:40.531822 | 2026-04-22 02:21:40.535862 | localhost | skipping: Conditional result was False 2026-04-22 02:21:40.552400 | 2026-04-22 02:21:40.552591 | LOOP [upload-logs : Upload console log and json output]