2026-04-18 17:50:12.935448 | Job console starting 2026-04-18 17:50:12.946028 | Updating git repos 2026-04-18 17:50:12.997968 | Cloning repos into workspace 2026-04-18 17:50:13.063841 | Restoring repo states 2026-04-18 17:50:13.075335 | Merging changes 2026-04-18 17:50:13.661759 | Checking out repos 2026-04-18 17:50:13.952981 | Preparing playbooks 2026-04-18 17:50:16.934407 | Running Ansible setup 2026-04-18 17:50:21.354252 | PRE-RUN START: [trusted : github.com/vexxhost/zuul-config/playbooks/base/pre.yaml@main] 2026-04-18 17:50:22.043503 | 2026-04-18 17:50:22.121536 | PLAY [localhost] 2026-04-18 17:50:22.137869 | 2026-04-18 17:50:22.137985 | TASK [Gathering Facts] 2026-04-18 17:50:23.048090 | localhost | ok 2026-04-18 17:50:23.057744 | 2026-04-18 17:50:23.057915 | TASK [Setup log path fact] 2026-04-18 17:50:23.078425 | localhost | ok 2026-04-18 17:50:23.090953 | 2026-04-18 17:50:23.091189 | TASK [set-zuul-log-path-fact : Set log path for a build] 2026-04-18 17:50:23.122171 | localhost | ok 2026-04-18 17:50:23.131324 | 2026-04-18 17:50:23.131442 | TASK [emit-job-header : Print job information] 2026-04-18 17:50:23.172716 | # Job Information 2026-04-18 17:50:23.172931 | Ansible Version: 2.16.16 2026-04-18 17:50:23.173027 | Job: ansible-collection-kubernetes-molecule-helm 2026-04-18 17:50:23.173067 | Pipeline: check 2026-04-18 17:50:23.173099 | Executor: 0a8996d2b663 2026-04-18 17:50:23.173129 | Triggered by: https://github.com/vexxhost/ansible-collection-kubernetes/pull/259 2026-04-18 17:50:23.173163 | Event ID: 588572d0-3b4c-11f1-8812-b53b9a62ea82 2026-04-18 17:50:23.177952 | 2026-04-18 17:50:23.178125 | LOOP [emit-job-header : Print node information] 2026-04-18 17:50:23.272438 | localhost | ok: 2026-04-18 17:50:23.272692 | localhost | # Node Information 2026-04-18 17:50:23.272760 | localhost | Inventory Hostname: controller 2026-04-18 17:50:23.272811 | localhost | Hostname: np0000167592 2026-04-18 17:50:23.272856 | localhost | Username: zuul 2026-04-18 17:50:23.272907 | localhost | Distro: Debian 13.4 2026-04-18 17:50:23.272985 | localhost | Provider: yul1 2026-04-18 17:50:23.273062 | localhost | Region: ca-ymq-1 2026-04-18 17:50:23.273114 | localhost | Label: debian-trixie 2026-04-18 17:50:23.273158 | localhost | Product Name: OpenStack Nova 2026-04-18 17:50:23.273221 | localhost | Interface IP: 199.19.213.122 2026-04-18 17:50:23.280946 | 2026-04-18 17:50:23.281088 | TASK [log-inventory : Ensure Zuul Ansible directory exists] 2026-04-18 17:50:23.669211 | localhost -> localhost | changed 2026-04-18 17:50:23.674420 | 2026-04-18 17:50:23.674497 | TASK [log-inventory : Copy ansible inventory to logs dir] 2026-04-18 17:50:24.559792 | localhost -> localhost | changed 2026-04-18 17:50:24.565692 | 2026-04-18 17:50:24.565751 | PLAY [all] 2026-04-18 17:50:24.572872 | 2026-04-18 17:50:24.573011 | TASK [add-build-sshkey : Check to see if ssh key was already created for this build] 2026-04-18 17:50:24.779194 | controller -> localhost | ok 2026-04-18 17:50:24.788999 | 2026-04-18 17:50:24.789117 | TASK [add-build-sshkey : Create a new key in workspace based on build UUID] 2026-04-18 17:50:24.821525 | controller | ok 2026-04-18 17:50:24.842685 | controller | included: /var/lib/zuul/builds/bb8724c2f3824dd8a927124a4d73fa4b/trusted/project_1/opendev.org/zuul/zuul-jobs/roles/add-build-sshkey/tasks/create-key-and-replace.yaml 2026-04-18 17:50:24.850011 | 2026-04-18 17:50:24.850101 | TASK [add-build-sshkey : Create Temp SSH key] 2026-04-18 17:50:25.913491 | controller -> localhost | Generating public/private rsa key pair. 2026-04-18 17:50:25.913692 | controller -> localhost | Your identification has been saved in /var/lib/zuul/builds/bb8724c2f3824dd8a927124a4d73fa4b/work/bb8724c2f3824dd8a927124a4d73fa4b_id_rsa 2026-04-18 17:50:25.913738 | controller -> localhost | Your public key has been saved in /var/lib/zuul/builds/bb8724c2f3824dd8a927124a4d73fa4b/work/bb8724c2f3824dd8a927124a4d73fa4b_id_rsa.pub 2026-04-18 17:50:25.913773 | controller -> localhost | The key fingerprint is: 2026-04-18 17:50:25.913805 | controller -> localhost | SHA256:vbKIKGy+WH82xtr72YJHHzeyIzZaqV1nR7N957I9nps zuul-build-sshkey 2026-04-18 17:50:25.913853 | controller -> localhost | The key's randomart image is: 2026-04-18 17:50:25.913885 | controller -> localhost | +---[RSA 3072]----+ 2026-04-18 17:50:25.913923 | controller -> localhost | | | 2026-04-18 17:50:25.913956 | controller -> localhost | | | 2026-04-18 17:50:25.913986 | controller -> localhost | | | 2026-04-18 17:50:25.914016 | controller -> localhost | | . | 2026-04-18 17:50:25.914045 | controller -> localhost | | S . o | 2026-04-18 17:50:25.914075 | controller -> localhost | | ..o.o. + | 2026-04-18 17:50:25.914104 | controller -> localhost | |. . . o+.o=o.o +| 2026-04-18 17:50:25.914134 | controller -> localhost | |o+ o oB=**+o ..+=| 2026-04-18 17:50:25.914167 | controller -> localhost | |++o +=*B=+.. oE=| 2026-04-18 17:50:25.914197 | controller -> localhost | +----[SHA256]-----+ 2026-04-18 17:50:25.914281 | controller -> localhost | ok: Runtime: 0:00:00.644867 2026-04-18 17:50:25.924009 | 2026-04-18 17:50:25.924312 | TASK [add-build-sshkey : Remote setup ssh keys (linux)] 2026-04-18 17:50:25.958295 | controller | ok 2026-04-18 17:50:25.974406 | controller | included: /var/lib/zuul/builds/bb8724c2f3824dd8a927124a4d73fa4b/trusted/project_1/opendev.org/zuul/zuul-jobs/roles/add-build-sshkey/tasks/remote-linux.yaml 2026-04-18 17:50:25.992918 | 2026-04-18 17:50:25.993051 | TASK [add-build-sshkey : Remove previously added zuul-build-sshkey] 2026-04-18 17:50:26.024523 | controller | skipping: Conditional result was False 2026-04-18 17:50:26.035324 | 2026-04-18 17:50:26.050300 | TASK [add-build-sshkey : Enable access via build key on all nodes] 2026-04-18 17:50:26.624053 | controller | changed 2026-04-18 17:50:26.683366 | 2026-04-18 17:50:26.683492 | TASK [add-build-sshkey : Make sure user has a .ssh] 2026-04-18 17:50:26.888581 | controller | ok 2026-04-18 17:50:26.987740 | 2026-04-18 17:50:26.987929 | TASK [add-build-sshkey : Install build private key as SSH key on all nodes] 2026-04-18 17:50:27.522650 | controller | changed 2026-04-18 17:50:28.288358 | 2026-04-18 17:50:28.288515 | TASK [add-build-sshkey : Install build public key as SSH key on all nodes] 2026-04-18 17:50:28.819722 | controller | changed 2026-04-18 17:50:28.827155 | 2026-04-18 17:50:28.827249 | TASK [add-build-sshkey : Remote setup ssh keys (windows)] 2026-04-18 17:50:28.848737 | controller | skipping: Conditional result was False 2026-04-18 17:50:28.854255 | 2026-04-18 17:50:28.854325 | TASK [remove-zuul-sshkey : Remove master key from local agent] 2026-04-18 17:50:29.285392 | controller -> localhost | changed 2026-04-18 17:50:29.297086 | 2026-04-18 17:50:29.297187 | TASK [add-build-sshkey : Add back temp key] 2026-04-18 17:50:29.581770 | controller -> localhost | Identity added: /var/lib/zuul/builds/bb8724c2f3824dd8a927124a4d73fa4b/work/bb8724c2f3824dd8a927124a4d73fa4b_id_rsa (zuul-build-sshkey) 2026-04-18 17:50:29.581989 | controller -> localhost | ok: Runtime: 0:00:00.013650 2026-04-18 17:50:29.587239 | 2026-04-18 17:50:29.587310 | TASK [add-build-sshkey : Verify we can still SSH to all nodes] 2026-04-18 17:50:29.954514 | controller | ok 2026-04-18 17:50:29.959335 | 2026-04-18 17:50:29.959402 | TASK [add-build-sshkey : Verify we can still SSH to all nodes (windows)] 2026-04-18 17:50:29.983581 | controller | skipping: Conditional result was False 2026-04-18 17:50:29.997874 | 2026-04-18 17:50:29.997962 | TASK [prepare-workspace : Start zuul_console daemon.] 2026-04-18 17:50:30.364362 | controller | ok 2026-04-18 17:50:30.370382 | 2026-04-18 17:50:30.370461 | TASK [prepare-workspace : Synchronize src repos to workspace directory.] 2026-04-18 17:50:31.422765 | controller | Output suppressed because no_log was given 2026-04-18 17:50:31.432382 | 2026-04-18 17:50:31.432447 | LOOP [ensure-output-dirs : Empty Zuul Output directories by removing them] 2026-04-18 17:50:31.637791 | controller | ok: "logs" 2026-04-18 17:50:31.638058 | controller | ok: All items complete 2026-04-18 17:50:31.638087 | 2026-04-18 17:50:31.818080 | controller | ok: "artifacts" 2026-04-18 17:50:31.998968 | controller | ok: "docs" 2026-04-18 17:50:32.009558 | 2026-04-18 17:50:32.009704 | LOOP [ensure-output-dirs : Ensure Zuul Output directories exist] 2026-04-18 17:50:32.225215 | controller | changed: "logs" 2026-04-18 17:50:32.419097 | controller | changed: "artifacts" 2026-04-18 17:50:32.602649 | controller | changed: "docs" 2026-04-18 17:50:32.624168 | 2026-04-18 17:50:32.624306 | PLAY RECAP 2026-04-18 17:50:32.624372 | controller | ok: 15 changed: 8 unreachable: 0 failed: 0 skipped: 3 rescued: 0 ignored: 0 2026-04-18 17:50:32.624413 | localhost | ok: 6 changed: 2 unreachable: 0 failed: 0 skipped: 0 rescued: 0 ignored: 0 2026-04-18 17:50:32.624443 | 2026-04-18 17:50:32.758843 | PRE-RUN END RESULT_NORMAL: [trusted : github.com/vexxhost/zuul-config/playbooks/base/pre.yaml@main] 2026-04-18 17:50:32.761417 | PRE-RUN START: [untrusted : github.com/vexxhost/zuul-jobs/playbooks/molecule/pre.yaml@main] 2026-04-18 17:50:33.435450 | 2026-04-18 17:50:33.435639 | PLAY [all] 2026-04-18 17:50:33.449376 | 2026-04-18 17:50:33.449555 | TASK [setup-uv : Extract archive] 2026-04-18 17:50:35.786891 | controller | changed 2026-04-18 17:50:35.795053 | 2026-04-18 17:50:35.795152 | TASK [setup-uv : Print version] 2026-04-18 17:50:36.157250 | controller | uv 0.8.13 2026-04-18 17:50:36.754690 | controller | ok: Runtime: 0:00:00.015119 2026-04-18 17:50:36.768529 | 2026-04-18 17:50:36.768666 | PLAY RECAP 2026-04-18 17:50:36.768739 | controller | ok: 2 changed: 2 unreachable: 0 failed: 0 skipped: 0 rescued: 0 ignored: 0 2026-04-18 17:50:36.768776 | 2026-04-18 17:50:36.934001 | PRE-RUN END RESULT_NORMAL: [untrusted : github.com/vexxhost/zuul-jobs/playbooks/molecule/pre.yaml@main] 2026-04-18 17:50:36.936795 | PRE-RUN START: [untrusted : github.com/vexxhost/ansible-collection-kubernetes/test-playbooks/molecule/pre.yml@main] 2026-04-18 17:50:37.510258 | 2026-04-18 17:50:37.510386 | PLAY [all] 2026-04-18 17:50:37.520082 | 2026-04-18 17:50:37.520157 | TASK [Update apt cache] 2026-04-18 17:50:42.254112 | controller | ok 2026-04-18 17:50:42.261278 | 2026-04-18 17:50:42.261408 | TASK [Disable firewalld] 2026-04-18 17:50:42.298490 | controller | skipping: Conditional result was False 2026-04-18 17:50:42.306083 | 2026-04-18 17:50:42.306195 | TASK [Install "jq" for log collection] 2026-04-18 17:50:45.272437 | controller | changed 2026-04-18 17:50:45.274231 | 2026-04-18 17:50:45.274281 | PLAY RECAP 2026-04-18 17:50:45.274327 | controller | ok: 2 changed: 1 unreachable: 0 failed: 0 skipped: 1 rescued: 0 ignored: 0 2026-04-18 17:50:45.274349 | 2026-04-18 17:50:45.407706 | PRE-RUN END RESULT_NORMAL: [untrusted : github.com/vexxhost/ansible-collection-kubernetes/test-playbooks/molecule/pre.yml@main] 2026-04-18 17:50:45.410612 | RUN START: [untrusted : github.com/vexxhost/zuul-jobs/playbooks/molecule/run.yaml@main] 2026-04-18 17:50:46.019621 | 2026-04-18 17:50:46.068898 | PLAY [all] 2026-04-18 17:50:46.084867 | 2026-04-18 17:50:46.084992 | TASK [Copy inventory file for Zuul] 2026-04-18 17:50:47.073433 | controller | changed 2026-04-18 17:50:47.082472 | 2026-04-18 17:50:47.094918 | TASK [Switch "ansible_host" to private IP] 2026-04-18 17:50:47.414461 | controller | changed: 1 replacements made 2026-04-18 17:50:47.535781 | 2026-04-18 17:50:47.543175 | TASK [Run Molecule scenario] 2026-04-18 17:50:47.984638 | controller | Using CPython 3.13.5 interpreter at: /usr/bin/python3 2026-04-18 17:50:47.984730 | controller | Creating virtual environment at: .venv 2026-04-18 17:50:48.279083 | controller | Downloading pygments (1.2MiB) 2026-04-18 17:50:48.279730 | controller | Downloading ansible-core (2.3MiB) 2026-04-18 17:50:48.281303 | controller | Downloading cryptography (4.3MiB) 2026-04-18 17:50:48.501002 | controller | Downloading cryptography 2026-04-18 17:50:48.556790 | controller | Downloading pygments 2026-04-18 17:50:48.742889 | controller | Downloading ansible-core 2026-04-18 17:50:48.792747 | controller | Installed 36 packages in 48ms 2026-04-18 17:50:49.471667 | controller | INFO Collection 'vexxhost.kubernetes' detected. 2026-04-18 17:50:49.471755 | controller | INFO Scenarios will be used from 'extensions/molecule' 2026-04-18 17:50:50.291201 | controller | CRITICAL 'extensions/molecule/default/molecule.yml' glob failed. Exiting. 2026-04-18 17:50:50.291235 | controller | INFO default scenario not found, disabling shared state. 2026-04-18 17:50:50.291372 | controller | INFO [helm > discovery] scenario test matrix: dependency, cleanup, destroy, syntax, create, prepare, converge, idempotence, side_effect, verify, cleanup, destroy 2026-04-18 17:50:50.291429 | controller | INFO [helm > prerun] Performing prerun with role_name_check=0... 2026-04-18 17:51:05.182927 | controller | INFO [helm > dependency] Executing 2026-04-18 17:51:05.182995 | controller | WARNING [helm > dependency] Missing roles requirements file: requirements.yml 2026-04-18 17:51:05.183229 | controller | WARNING [helm > dependency] Missing collections requirements file: collections.yml 2026-04-18 17:51:05.183348 | controller | WARNING [helm > dependency] Executed: 2 missing (Remove from test_sequence to suppress) 2026-04-18 17:51:05.188778 | controller | INFO [helm > cleanup] Executing 2026-04-18 17:51:05.189105 | controller | WARNING [helm > cleanup] Executed: Missing playbook (Remove from test_sequence to suppress) 2026-04-18 17:51:05.194314 | controller | INFO [helm > destroy] Executing 2026-04-18 17:51:05.194338 | controller | WARNING [helm > destroy] Skipping, '--destroy=never' requested. 2026-04-18 17:51:05.194385 | controller | INFO [helm > destroy] Executed: Successful 2026-04-18 17:51:05.199915 | controller | INFO [helm > syntax] Executing 2026-04-18 17:51:06.052345 | controller | 2026-04-18 17:51:06.052542 | controller | playbook: /home/zuul/src/github.com/vexxhost/ansible-collection-kubernetes/extensions/molecule/helm/converge.yml 2026-04-18 17:51:06.109969 | controller | INFO [helm > syntax] Executed: Successful 2026-04-18 17:51:06.119927 | controller | INFO [helm > create] Executing 2026-04-18 17:51:06.121978 | controller | WARNING [helm > create] Executed: Missing playbook (Remove from test_sequence to suppress) 2026-04-18 17:51:06.127447 | controller | INFO [helm > prepare] Executing 2026-04-18 17:51:06.929926 | controller | 2026-04-18 17:51:06.930114 | controller | PLAY [Prepare] ***************************************************************** 2026-04-18 17:51:06.930296 | controller | 2026-04-18 17:51:06.930515 | controller | TASK [Gathering Facts] ********************************************************* 2026-04-18 17:51:06.930786 | controller | Saturday 18 April 2026 17:51:06 +0000 (0:00:00.028) 0:00:00.028 ******** 2026-04-18 17:51:09.198573 | 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-18 17:51:09.206377 | controller | ok: [controller] 2026-04-18 17:51:09.206441 | controller | 2026-04-18 17:51:09.206704 | controller | TASK [Install Debian packages] ************************************************* 2026-04-18 17:51:09.206906 | controller | Saturday 18 April 2026 17:51:09 +0000 (0:00:02.276) 0:00:02.304 ******** 2026-04-18 17:51:10.623315 | controller | ok: [controller] 2026-04-18 17:51:10.623448 | controller | 2026-04-18 17:51:10.623638 | controller | PLAY RECAP ********************************************************************* 2026-04-18 17:51:10.623848 | controller | controller : ok=2 changed=0 unreachable=0 failed=0 skipped=0 rescued=0 ignored=0 2026-04-18 17:51:10.624016 | controller | 2026-04-18 17:51:10.624183 | controller | 2026-04-18 17:51:10.624360 | controller | TASKS RECAP ******************************************************************** 2026-04-18 17:51:10.624581 | controller | Saturday 18 April 2026 17:51:10 +0000 (0:00:01.413) 0:00:03.718 ******** 2026-04-18 17:51:10.624754 | controller | =============================================================================== 2026-04-18 17:51:10.624936 | controller | Gathering Facts --------------------------------------------------------- 2.28s 2026-04-18 17:51:10.625121 | controller | Install Debian packages ------------------------------------------------- 1.41s 2026-04-18 17:51:10.770705 | controller | INFO [helm > prepare] Executed: Successful 2026-04-18 17:51:10.780404 | controller | INFO [helm > converge] Executing 2026-04-18 17:51:11.635784 | controller | 2026-04-18 17:51:11.635925 | controller | PLAY [Converge] **************************************************************** 2026-04-18 17:51:11.636155 | controller | 2026-04-18 17:51:11.636325 | controller | TASK [Gathering Facts] ********************************************************* 2026-04-18 17:51:11.636564 | controller | Saturday 18 April 2026 17:51:11 +0000 (0:00:00.012) 0:00:00.012 ******** 2026-04-18 17:51:12.699575 | 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-18 17:51:12.703269 | controller | ok: [controller] 2026-04-18 17:51:12.703470 | controller | 2026-04-18 17:51:12.703670 | controller | TASK [vexxhost.containers.forget_package : Forget package] ********************* 2026-04-18 17:51:12.703883 | controller | Saturday 18 April 2026 17:51:12 +0000 (0:00:01.067) 0:00:01.080 ******** 2026-04-18 17:51:13.183014 | controller | ok: [controller] 2026-04-18 17:51:13.183066 | controller | 2026-04-18 17:51:13.183127 | controller | TASK [vexxhost.containers.package : Update state for tar] ********************** 2026-04-18 17:51:13.183214 | controller | Saturday 18 April 2026 17:51:13 +0000 (0:00:00.476) 0:00:01.556 ******** 2026-04-18 17:51:14.303135 | controller | ok: [controller] 2026-04-18 17:51:14.303262 | controller | 2026-04-18 17:51:14.303528 | controller | TASK [vexxhost.containers.directory : Create directory (/var/lib/downloads)] *** 2026-04-18 17:51:14.303741 | controller | Saturday 18 April 2026 17:51:14 +0000 (0:00:01.122) 0:00:02.679 ******** 2026-04-18 17:51:14.725156 | controller | changed: [controller] 2026-04-18 17:51:14.725235 | controller | 2026-04-18 17:51:14.725446 | controller | TASK [vexxhost.containers.download_artifact : Starting download of file] ******* 2026-04-18 17:51:14.725632 | controller | Saturday 18 April 2026 17:51:14 +0000 (0:00:00.421) 0:00:03.101 ******** 2026-04-18 17:51:14.779115 | controller | ok: [controller] => { 2026-04-18 17:51:14.779269 | controller | "msg": "https://get.helm.sh/helm-v3.11.2-linux-amd64.tar.gz" 2026-04-18 17:51:14.779501 | controller | } 2026-04-18 17:51:14.779625 | controller | 2026-04-18 17:51:14.779871 | controller | TASK [vexxhost.containers.download_artifact : Download item] ******************* 2026-04-18 17:51:14.780000 | controller | Saturday 18 April 2026 17:51:14 +0000 (0:00:00.054) 0:00:03.155 ******** 2026-04-18 17:51:15.559100 | controller | [WARNING]: Module remote_tmp /root/.ansible/tmp did not exist and was created with a mode of 0700, this may cause issues when running as another user. To avoid this, create the remote_tmp dir with the correct permissions manually 2026-04-18 17:51:15.569949 | controller | changed: [controller] 2026-04-18 17:51:15.570128 | controller | 2026-04-18 17:51:15.570325 | controller | TASK [vexxhost.containers.download_artifact : Extract archive] ***************** 2026-04-18 17:51:15.570538 | controller | Saturday 18 April 2026 17:51:15 +0000 (0:00:00.790) 0:00:03.946 ******** 2026-04-18 17:51:18.600208 | controller | changed: [controller] 2026-04-18 17:51:18.600269 | controller | 2026-04-18 17:51:18.600327 | controller | TASK [vexxhost.kubernetes.helm : Remove Helm repository] *********************** 2026-04-18 17:51:18.600412 | controller | Saturday 18 April 2026 17:51:18 +0000 (0:00:03.029) 0:00:06.976 ******** 2026-04-18 17:51:19.097547 | controller | ok: [controller] 2026-04-18 17:51:19.097655 | controller | 2026-04-18 17:51:19.097856 | controller | TASK [vexxhost.kubernetes.helm : Add bash autocomplete for helm] *************** 2026-04-18 17:51:19.098051 | controller | Saturday 18 April 2026 17:51:19 +0000 (0:00:00.496) 0:00:07.472 ******** 2026-04-18 17:51:19.514330 | controller | changed: [controller] 2026-04-18 17:51:19.514371 | controller | 2026-04-18 17:51:19.514386 | controller | TASK [vexxhost.kubernetes.helm : Get Helm plugins dir] ************************* 2026-04-18 17:51:19.514610 | controller | Saturday 18 April 2026 17:51:19 +0000 (0:00:00.417) 0:00:07.889 ******** 2026-04-18 17:51:19.970725 | controller | ok: [controller] 2026-04-18 17:51:19.970785 | controller | 2026-04-18 17:51:19.970925 | controller | TASK [vexxhost.kubernetes.helm : Create Helm plugins directory if it does not exist] *** 2026-04-18 17:51:19.971046 | controller | Saturday 18 April 2026 17:51:19 +0000 (0:00:00.453) 0:00:08.343 ******** 2026-04-18 17:51:20.267041 | controller | changed: [controller] 2026-04-18 17:51:20.267183 | controller | 2026-04-18 17:51:20.267396 | controller | TASK [vexxhost.kubernetes.helm : Remove Helm diff plugin installed by kubernetes.core.helm_plugin] *** 2026-04-18 17:51:20.267605 | controller | Saturday 18 April 2026 17:51:20 +0000 (0:00:00.299) 0:00:08.642 ******** 2026-04-18 17:51:20.562167 | controller | ok: [controller] 2026-04-18 17:51:20.562324 | controller | 2026-04-18 17:51:20.562567 | controller | TASK [Install plugin] ********************************************************** 2026-04-18 17:51:20.562766 | controller | Saturday 18 April 2026 17:51:20 +0000 (0:00:00.295) 0:00:08.938 ******** 2026-04-18 17:51:20.615264 | controller | included: vexxhost.containers.download_artifact for controller 2026-04-18 17:51:20.615443 | controller | 2026-04-18 17:51:20.615700 | controller | TASK [vexxhost.containers.download_artifact : Starting download of file] ******* 2026-04-18 17:51:20.615960 | controller | Saturday 18 April 2026 17:51:20 +0000 (0:00:00.053) 0:00:08.991 ******** 2026-04-18 17:51:20.665144 | controller | ok: [controller] => { 2026-04-18 17:51:20.665362 | controller | "msg": "https://github.com/databus23/helm-diff/releases/download/v3.8.1/helm-diff-linux-amd64.tgz" 2026-04-18 17:51:20.665553 | controller | } 2026-04-18 17:51:20.665727 | controller | 2026-04-18 17:51:20.665927 | controller | TASK [vexxhost.containers.download_artifact : Download item] ******************* 2026-04-18 17:51:20.666126 | controller | Saturday 18 April 2026 17:51:20 +0000 (0:00:00.049) 0:00:09.041 ******** 2026-04-18 17:51:21.547080 | controller | changed: [controller] 2026-04-18 17:51:21.547371 | controller | 2026-04-18 17:51:21.547641 | controller | TASK [vexxhost.containers.download_artifact : Extract archive] ***************** 2026-04-18 17:51:21.547912 | controller | Saturday 18 April 2026 17:51:21 +0000 (0:00:00.880) 0:00:09.921 ******** 2026-04-18 17:51:23.632430 | controller | changed: [controller] 2026-04-18 17:51:23.632716 | controller | 2026-04-18 17:51:23.632974 | controller | PLAY RECAP ********************************************************************* 2026-04-18 17:51:23.633245 | controller | controller : ok=16 changed=7 unreachable=0 failed=0 skipped=0 rescued=0 ignored=0 2026-04-18 17:51:23.633508 | controller | 2026-04-18 17:51:23.633734 | controller | 2026-04-18 17:51:23.633979 | controller | TASKS RECAP ******************************************************************** 2026-04-18 17:51:23.634229 | controller | Saturday 18 April 2026 17:51:23 +0000 (0:00:02.087) 0:00:12.009 ******** 2026-04-18 17:51:23.634520 | controller | =============================================================================== 2026-04-18 17:51:23.634783 | controller | vexxhost.containers.download_artifact : Extract archive ----------------- 3.03s 2026-04-18 17:51:23.635037 | controller | vexxhost.containers.download_artifact : Extract archive ----------------- 2.09s 2026-04-18 17:51:23.635281 | controller | vexxhost.containers.package : Update state for tar ---------------------- 1.12s 2026-04-18 17:51:23.635524 | controller | Gathering Facts --------------------------------------------------------- 1.07s 2026-04-18 17:51:23.635769 | controller | vexxhost.containers.download_artifact : Download item ------------------- 0.88s 2026-04-18 17:51:23.636022 | controller | vexxhost.containers.download_artifact : Download item ------------------- 0.79s 2026-04-18 17:51:23.636266 | controller | vexxhost.kubernetes.helm : Remove Helm repository ----------------------- 0.50s 2026-04-18 17:51:23.636509 | controller | vexxhost.containers.forget_package : Forget package --------------------- 0.48s 2026-04-18 17:51:23.636752 | controller | vexxhost.kubernetes.helm : Get Helm plugins dir ------------------------- 0.45s 2026-04-18 17:51:23.636999 | controller | vexxhost.containers.directory : Create directory (/var/lib/downloads) --- 0.42s 2026-04-18 17:51:23.637261 | controller | vexxhost.kubernetes.helm : Add bash autocomplete for helm --------------- 0.42s 2026-04-18 17:51:23.637574 | controller | vexxhost.kubernetes.helm : Create Helm plugins directory if it does not exist --- 0.30s 2026-04-18 17:51:23.637829 | controller | vexxhost.kubernetes.helm : Remove Helm diff plugin installed by kubernetes.core.helm_plugin --- 0.30s 2026-04-18 17:51:23.638005 | controller | vexxhost.containers.download_artifact : Starting download of file ------- 0.05s 2026-04-18 17:51:23.638155 | controller | Install plugin ---------------------------------------------------------- 0.05s 2026-04-18 17:51:23.638306 | controller | vexxhost.containers.download_artifact : Starting download of file ------- 0.05s 2026-04-18 17:51:23.778264 | controller | INFO [helm > converge] Executed: Successful 2026-04-18 17:51:23.788093 | controller | INFO [helm > idempotence] Executing 2026-04-18 17:51:24.613054 | controller | 2026-04-18 17:51:24.613347 | controller | PLAY [Converge] **************************************************************** 2026-04-18 17:51:24.613588 | controller | 2026-04-18 17:51:24.613868 | controller | TASK [Gathering Facts] ********************************************************* 2026-04-18 17:51:24.614132 | controller | Saturday 18 April 2026 17:51:24 +0000 (0:00:00.012) 0:00:00.012 ******** 2026-04-18 17:51:25.636073 | 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-18 17:51:25.641689 | controller | ok: [controller] 2026-04-18 17:51:25.641713 | controller | 2026-04-18 17:51:25.641723 | controller | TASK [vexxhost.containers.forget_package : Forget package] ********************* 2026-04-18 17:51:25.641732 | controller | Saturday 18 April 2026 17:51:25 +0000 (0:00:01.027) 0:00:01.040 ******** 2026-04-18 17:51:26.065216 | controller | ok: [controller] 2026-04-18 17:51:26.065552 | controller | 2026-04-18 17:51:26.065825 | controller | TASK [vexxhost.containers.package : Update state for tar] ********************** 2026-04-18 17:51:26.066080 | controller | Saturday 18 April 2026 17:51:26 +0000 (0:00:00.423) 0:00:01.464 ******** 2026-04-18 17:51:27.253090 | controller | ok: [controller] 2026-04-18 17:51:27.253371 | controller | 2026-04-18 17:51:27.253636 | controller | TASK [vexxhost.containers.directory : Create directory (/var/lib/downloads)] *** 2026-04-18 17:51:27.253887 | controller | Saturday 18 April 2026 17:51:27 +0000 (0:00:01.187) 0:00:02.651 ******** 2026-04-18 17:51:27.667133 | controller | ok: [controller] 2026-04-18 17:51:27.667450 | controller | 2026-04-18 17:51:27.667715 | controller | TASK [vexxhost.containers.download_artifact : Starting download of file] ******* 2026-04-18 17:51:27.667986 | controller | Saturday 18 April 2026 17:51:27 +0000 (0:00:00.414) 0:00:03.065 ******** 2026-04-18 17:51:27.717717 | controller | ok: [controller] => { 2026-04-18 17:51:27.718008 | controller | "msg": "https://get.helm.sh/helm-v3.11.2-linux-amd64.tar.gz" 2026-04-18 17:51:27.718258 | controller | } 2026-04-18 17:51:27.718533 | controller | 2026-04-18 17:51:27.718794 | controller | TASK [vexxhost.containers.download_artifact : Download item] ******************* 2026-04-18 17:51:27.719046 | controller | Saturday 18 April 2026 17:51:27 +0000 (0:00:00.051) 0:00:03.116 ******** 2026-04-18 17:51:28.246567 | controller | ok: [controller] 2026-04-18 17:51:28.246858 | controller | 2026-04-18 17:51:28.247130 | controller | TASK [vexxhost.containers.download_artifact : Extract archive] ***************** 2026-04-18 17:51:28.247387 | controller | Saturday 18 April 2026 17:51:28 +0000 (0:00:00.528) 0:00:03.645 ******** 2026-04-18 17:51:29.938368 | controller | ok: [controller] 2026-04-18 17:51:29.938393 | controller | 2026-04-18 17:51:29.938398 | controller | TASK [vexxhost.kubernetes.helm : Remove Helm repository] *********************** 2026-04-18 17:51:29.938402 | controller | Saturday 18 April 2026 17:51:29 +0000 (0:00:01.689) 0:00:05.334 ******** 2026-04-18 17:51:30.428750 | controller | ok: [controller] 2026-04-18 17:51:30.428810 | controller | 2026-04-18 17:51:30.428873 | controller | TASK [vexxhost.kubernetes.helm : Add bash autocomplete for helm] *************** 2026-04-18 17:51:30.428955 | controller | Saturday 18 April 2026 17:51:30 +0000 (0:00:00.489) 0:00:05.823 ******** 2026-04-18 17:51:30.818853 | controller | ok: [controller] 2026-04-18 17:51:30.818877 | controller | 2026-04-18 17:51:30.818881 | controller | TASK [vexxhost.kubernetes.helm : Get Helm plugins dir] ************************* 2026-04-18 17:51:30.818885 | controller | Saturday 18 April 2026 17:51:30 +0000 (0:00:00.393) 0:00:06.217 ******** 2026-04-18 17:51:31.274109 | controller | ok: [controller] 2026-04-18 17:51:31.274191 | controller | 2026-04-18 17:51:31.274329 | controller | TASK [vexxhost.kubernetes.helm : Create Helm plugins directory if it does not exist] *** 2026-04-18 17:51:31.274454 | controller | Saturday 18 April 2026 17:51:31 +0000 (0:00:00.455) 0:00:06.672 ******** 2026-04-18 17:51:31.595136 | controller | ok: [controller] 2026-04-18 17:51:31.595236 | controller | 2026-04-18 17:51:31.595392 | controller | TASK [vexxhost.kubernetes.helm : Remove Helm diff plugin installed by kubernetes.core.helm_plugin] *** 2026-04-18 17:51:31.595520 | controller | Saturday 18 April 2026 17:51:31 +0000 (0:00:00.317) 0:00:06.989 ******** 2026-04-18 17:51:31.888701 | controller | ok: [controller] 2026-04-18 17:51:31.888812 | controller | 2026-04-18 17:51:31.889008 | controller | TASK [Install plugin] ********************************************************** 2026-04-18 17:51:31.889199 | controller | Saturday 18 April 2026 17:51:31 +0000 (0:00:00.296) 0:00:07.286 ******** 2026-04-18 17:51:31.942313 | controller | included: vexxhost.containers.download_artifact for controller 2026-04-18 17:51:31.942344 | controller | 2026-04-18 17:51:31.942431 | controller | TASK [vexxhost.containers.download_artifact : Starting download of file] ******* 2026-04-18 17:51:31.942561 | controller | Saturday 18 April 2026 17:51:31 +0000 (0:00:00.055) 0:00:07.341 ******** 2026-04-18 17:51:31.987460 | controller | ok: [controller] => { 2026-04-18 17:51:31.987540 | controller | "msg": "https://github.com/databus23/helm-diff/releases/download/v3.8.1/helm-diff-linux-amd64.tgz" 2026-04-18 17:51:31.987651 | controller | } 2026-04-18 17:51:31.987757 | controller | 2026-04-18 17:51:31.987882 | controller | TASK [vexxhost.containers.download_artifact : Download item] ******************* 2026-04-18 17:51:31.987996 | controller | Saturday 18 April 2026 17:51:31 +0000 (0:00:00.044) 0:00:07.386 ******** 2026-04-18 17:51:32.418394 | controller | ok: [controller] 2026-04-18 17:51:32.418440 | controller | 2026-04-18 17:51:32.418566 | controller | TASK [vexxhost.containers.download_artifact : Extract archive] ***************** 2026-04-18 17:51:32.418640 | controller | Saturday 18 April 2026 17:51:32 +0000 (0:00:00.430) 0:00:07.817 ******** 2026-04-18 17:51:34.066094 | controller | ok: [controller] 2026-04-18 17:51:34.066250 | controller | 2026-04-18 17:51:34.066442 | controller | PLAY RECAP ********************************************************************* 2026-04-18 17:51:34.066769 | controller | controller : ok=16 changed=0 unreachable=0 failed=0 skipped=0 rescued=0 ignored=0 2026-04-18 17:51:34.066943 | controller | 2026-04-18 17:51:34.067111 | controller | 2026-04-18 17:51:34.067300 | controller | TASKS RECAP ******************************************************************** 2026-04-18 17:51:34.067534 | controller | Saturday 18 April 2026 17:51:34 +0000 (0:00:01.647) 0:00:09.465 ******** 2026-04-18 17:51:34.067715 | controller | =============================================================================== 2026-04-18 17:51:34.067904 | controller | vexxhost.containers.download_artifact : Extract archive ----------------- 1.69s 2026-04-18 17:51:34.068088 | controller | vexxhost.containers.download_artifact : Extract archive ----------------- 1.65s 2026-04-18 17:51:34.068271 | controller | vexxhost.containers.package : Update state for tar ---------------------- 1.19s 2026-04-18 17:51:34.068453 | controller | Gathering Facts --------------------------------------------------------- 1.03s 2026-04-18 17:51:34.068639 | controller | vexxhost.containers.download_artifact : Download item ------------------- 0.53s 2026-04-18 17:51:34.068820 | controller | vexxhost.kubernetes.helm : Remove Helm repository ----------------------- 0.49s 2026-04-18 17:51:34.069008 | controller | vexxhost.kubernetes.helm : Get Helm plugins dir ------------------------- 0.46s 2026-04-18 17:51:34.069191 | controller | vexxhost.containers.download_artifact : Download item ------------------- 0.43s 2026-04-18 17:51:34.069372 | controller | vexxhost.containers.forget_package : Forget package --------------------- 0.42s 2026-04-18 17:51:34.069555 | controller | vexxhost.containers.directory : Create directory (/var/lib/downloads) --- 0.41s 2026-04-18 17:51:34.069740 | controller | vexxhost.kubernetes.helm : Add bash autocomplete for helm --------------- 0.39s 2026-04-18 17:51:34.069936 | controller | vexxhost.kubernetes.helm : Create Helm plugins directory if it does not exist --- 0.32s 2026-04-18 17:51:34.070130 | controller | vexxhost.kubernetes.helm : Remove Helm diff plugin installed by kubernetes.core.helm_plugin --- 0.30s 2026-04-18 17:51:34.070310 | controller | Install plugin ---------------------------------------------------------- 0.06s 2026-04-18 17:51:34.070576 | controller | vexxhost.containers.download_artifact : Starting download of file ------- 0.05s 2026-04-18 17:51:34.070795 | controller | vexxhost.containers.download_artifact : Starting download of file ------- 0.04s 2026-04-18 17:51:34.212125 | controller | INFO [helm > idempotence] Executed: Successful 2026-04-18 17:51:34.221887 | controller | INFO [helm > side_effect] Executing 2026-04-18 17:51:34.222321 | controller | WARNING [helm > side_effect] Executed: Missing playbook (Remove from test_sequence to suppress) 2026-04-18 17:51:34.227888 | controller | INFO [helm > verify] Executing 2026-04-18 17:51:35.077270 | controller | 2026-04-18 17:51:35.077333 | controller | PLAY [Verify] ****************************************************************** 2026-04-18 17:51:35.077564 | controller | 2026-04-18 17:51:35.077710 | controller | TASK [Gathering Facts] ********************************************************* 2026-04-18 17:51:35.077942 | controller | Saturday 18 April 2026 17:51:35 +0000 (0:00:00.009) 0:00:00.009 ******** 2026-04-18 17:51:36.174663 | 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-18 17:51:36.180405 | controller | ok: [controller] 2026-04-18 17:51:36.180592 | controller | 2026-04-18 17:51:36.180788 | controller | TASK [Get the current Helm version] ******************************************** 2026-04-18 17:51:36.180981 | controller | Saturday 18 April 2026 17:51:36 +0000 (0:00:01.103) 0:00:01.113 ******** 2026-04-18 17:51:36.638670 | controller | changed: [controller] 2026-04-18 17:51:36.638808 | controller | 2026-04-18 17:51:36.639001 | controller | TASK [Assert Helm version] ***************************************************** 2026-04-18 17:51:36.639193 | controller | Saturday 18 April 2026 17:51:36 +0000 (0:00:00.457) 0:00:01.571 ******** 2026-04-18 17:51:36.672067 | controller | ok: [controller] => { 2026-04-18 17:51:36.672239 | controller | "changed": false, 2026-04-18 17:51:36.672418 | controller | "msg": "All assertions passed" 2026-04-18 17:51:36.672595 | controller | } 2026-04-18 17:51:36.672759 | controller | 2026-04-18 17:51:36.672936 | controller | PLAY RECAP ********************************************************************* 2026-04-18 17:51:36.673138 | controller | controller : ok=3 changed=1 unreachable=0 failed=0 skipped=0 rescued=0 ignored=0 2026-04-18 17:51:36.673297 | controller | 2026-04-18 17:51:36.673456 | controller | 2026-04-18 17:51:36.673633 | controller | TASKS RECAP ******************************************************************** 2026-04-18 17:51:36.673818 | controller | Saturday 18 April 2026 17:51:36 +0000 (0:00:00.034) 0:00:01.605 ******** 2026-04-18 17:51:36.673988 | controller | =============================================================================== 2026-04-18 17:51:36.674168 | controller | Gathering Facts --------------------------------------------------------- 1.10s 2026-04-18 17:51:36.674349 | controller | Get the current Helm version -------------------------------------------- 0.46s 2026-04-18 17:51:36.674585 | controller | Assert Helm version ----------------------------------------------------- 0.03s 2026-04-18 17:51:36.786519 | controller | INFO [helm > verify] Executed: Successful 2026-04-18 17:51:36.794445 | controller | INFO [helm > cleanup] Executing 2026-04-18 17:51:36.794874 | controller | WARNING [helm > cleanup] Executed: Missing playbook (Remove from test_sequence to suppress) 2026-04-18 17:51:36.800779 | controller | INFO [helm > destroy] Executing 2026-04-18 17:51:36.800806 | controller | WARNING [helm > destroy] Skipping, '--destroy=never' requested. 2026-04-18 17:51:36.800897 | controller | INFO [helm > destroy] Executed: Successful 2026-04-18 17:51:36.801184 | controller | WARNING Molecule executed 1 scenario (1 missing files) 2026-04-18 17:51:37.130996 | controller | ok: Runtime: 0:00:48.969995 2026-04-18 17:51:37.136209 | 2026-04-18 17:51:37.136359 | PLAY RECAP 2026-04-18 17:51:37.136416 | controller | ok: 3 changed: 3 unreachable: 0 failed: 0 skipped: 0 rescued: 0 ignored: 0 2026-04-18 17:51:37.136443 | 2026-04-18 17:51:37.325953 | RUN END RESULT_NORMAL: [untrusted : github.com/vexxhost/zuul-jobs/playbooks/molecule/run.yaml@main] 2026-04-18 17:51:37.329028 | POST-RUN START: [untrusted : github.com/vexxhost/ansible-collection-kubernetes/test-playbooks/molecule/post.yml@main] 2026-04-18 17:51:37.993490 | 2026-04-18 17:51:38.022548 | PLAY [all] 2026-04-18 17:51:38.041285 | 2026-04-18 17:51:38.041444 | TASK [describe-kubernetes-objects : creating directory for cluster scoped objects] 2026-04-18 17:51:38.441421 | controller | changed 2026-04-18 17:51:38.448509 | 2026-04-18 17:51:38.448626 | TASK [describe-kubernetes-objects : Gathering descriptions for cluster scoped objects] 2026-04-18 17:51:38.833359 | controller | xargs: warning: options --max-args and --replace/-I/-i are mutually exclusive, ignoring previous --max-args value 2026-04-18 17:51:38.833449 | controller | xargs: warning: options --max-args and --replace/-I/-i are mutually exclusive, ignoring previous --max-args value 2026-04-18 17:51:38.842132 | controller | environment: line 1: kubectl: command not found 2026-04-18 17:51:38.844029 | controller | xargs: warning: options --max-lines and --replace/-I/-i are mutually exclusive, ignoring previous --max-lines value 2026-04-18 17:51:38.845840 | controller | environment: line 1: kubectl: command not found 2026-04-18 17:51:38.848267 | controller | xargs: warning: options --max-lines and --replace/-I/-i are mutually exclusive, ignoring previous --max-lines value 2026-04-18 17:51:38.850187 | controller | environment: line 1: kubectl: command not found 2026-04-18 17:51:38.853345 | controller | xargs: warning: options --max-lines and --replace/-I/-i are mutually exclusive, ignoring previous --max-lines value 2026-04-18 17:51:38.853927 | controller | environment: line 1: kubectl: command not found 2026-04-18 17:51:38.856376 | controller | xargs: warning: options --max-lines and --replace/-I/-i are mutually exclusive, ignoring previous --max-lines value 2026-04-18 17:51:38.859739 | controller | environment: line 1: kubectl: command not found 2026-04-18 17:51:38.860203 | controller | xargs: warning: options --max-lines and --replace/-I/-i are mutually exclusive, ignoring previous --max-lines value 2026-04-18 17:51:38.981037 | controller | ok: Runtime: 0:00:00.042894 2026-04-18 17:51:38.987305 | 2026-04-18 17:51:38.987398 | TASK [describe-kubernetes-objects : creating directory for namespace scoped objects] 2026-04-18 17:51:39.222090 | controller | changed 2026-04-18 17:51:39.226573 | 2026-04-18 17:51:39.226650 | TASK [describe-kubernetes-objects : Gathering descriptions for namespace scoped objects] 2026-04-18 17:51:39.478122 | controller | environment: line 5: kubectl: command not found 2026-04-18 17:51:39.479022 | controller | xargs: warning: options --max-args and --replace/-I/-i are mutually exclusive, ignoring previous --max-args value 2026-04-18 17:51:39.479388 | controller | xargs: warning: options --max-args and --replace/-I/-i are mutually exclusive, ignoring previous --max-args value 2026-04-18 17:51:39.479716 | controller | xargs: warning: options --max-args and --replace/-I/-i are mutually exclusive, ignoring previous --max-args value 2026-04-18 17:51:39.758759 | controller | ok: Runtime: 0:00:00.014780 2026-04-18 17:51:39.768171 | 2026-04-18 17:51:39.768395 | TASK [describe-kubernetes-objects : Downloads logs to executor] 2026-04-18 17:51:40.483518 | controller | changed: 2026-04-18 17:51:40.484065 | controller | created directory /var/lib/zuul/builds/bb8724c2f3824dd8a927124a4d73fa4b/work/logs/controller 2026-04-18 17:51:40.484134 | controller | cd+++++++++ objects/ 2026-04-18 17:51:40.484169 | controller | cd+++++++++ objects/cluster/ 2026-04-18 17:51:40.484202 | controller | cd+++++++++ objects/namespaced/ 2026-04-18 17:51:40.497638 | 2026-04-18 17:51:40.497725 | TASK [gather-pod-logs : creating directory for pod logs] 2026-04-18 17:51:40.748620 | controller | changed 2026-04-18 17:51:40.946396 | 2026-04-18 17:51:40.946496 | TASK [gather-pod-logs : creating directory for failed pod logs] 2026-04-18 17:51:41.180051 | controller | changed 2026-04-18 17:51:41.186053 | 2026-04-18 17:51:41.186174 | TASK [gather-pod-logs : retrieve all kubernetes logs, current and previous (if they exist)] 2026-04-18 17:51:41.449362 | controller | environment: line 3: kubectl: command not found 2026-04-18 17:51:41.724404 | controller | ok: Runtime: 0:00:00.013632 2026-04-18 17:51:41.730043 | 2026-04-18 17:51:41.730107 | TASK [gather-pod-logs : Downloads pod logs to executor] 2026-04-18 17:51:42.322821 | controller | changed: 2026-04-18 17:51:42.323012 | controller | cd+++++++++ pod-logs/ 2026-04-18 17:51:42.323044 | controller | cd+++++++++ pod-logs/failed-pods/ 2026-04-18 17:51:42.334602 | 2026-04-18 17:51:42.334731 | LOOP [helm-release-status : creating directory for helm release status] 2026-04-18 17:51:42.574605 | controller | changed: "values" 2026-04-18 17:51:42.774699 | controller | changed: "releases" 2026-04-18 17:51:42.785901 | 2026-04-18 17:51:42.786083 | TASK [helm-release-status : Gather get release status for helm charts] 2026-04-18 17:51:43.065246 | controller | /bin/bash: line 3: kubectl: command not found 2026-04-18 17:51:43.355787 | controller | ok: Runtime: 0:00:00.010637 2026-04-18 17:51:43.359793 | 2026-04-18 17:51:43.359898 | TASK [helm-release-status : Downloads logs to executor] 2026-04-18 17:51:43.946858 | controller | changed: 2026-04-18 17:51:43.947069 | controller | cd+++++++++ helm/ 2026-04-18 17:51:43.947108 | controller | cd+++++++++ helm/releases/ 2026-04-18 17:51:43.947141 | controller | cd+++++++++ helm/values/ 2026-04-18 17:51:43.956376 | 2026-04-18 17:51:43.956467 | PLAY RECAP 2026-04-18 17:51:43.956530 | controller | ok: 12 changed: 12 unreachable: 0 failed: 0 skipped: 0 rescued: 0 ignored: 0 2026-04-18 17:51:43.956560 | 2026-04-18 17:51:44.110215 | POST-RUN END RESULT_NORMAL: [untrusted : github.com/vexxhost/ansible-collection-kubernetes/test-playbooks/molecule/post.yml@main] 2026-04-18 17:51:44.112034 | POST-RUN START: [trusted : github.com/vexxhost/zuul-config/playbooks/base/post.yaml@main] 2026-04-18 17:51:44.692143 | 2026-04-18 17:51:44.692588 | PLAY [all] 2026-04-18 17:51:44.702790 | 2026-04-18 17:51:44.702875 | TASK [fetch-output : Set log path for multiple nodes] 2026-04-18 17:51:44.747453 | controller | skipping: Conditional result was False 2026-04-18 17:51:44.756352 | 2026-04-18 17:51:44.756456 | TASK [fetch-output : Set log path for single node] 2026-04-18 17:51:44.795699 | controller | ok 2026-04-18 17:51:44.801063 | 2026-04-18 17:51:44.801163 | LOOP [fetch-output : Ensure local output dirs] 2026-04-18 17:51:45.215963 | controller -> localhost | ok: "/var/lib/zuul/builds/bb8724c2f3824dd8a927124a4d73fa4b/work/logs" 2026-04-18 17:51:45.433279 | controller -> localhost | changed: "/var/lib/zuul/builds/bb8724c2f3824dd8a927124a4d73fa4b/work/artifacts" 2026-04-18 17:51:45.679231 | controller -> localhost | changed: "/var/lib/zuul/builds/bb8724c2f3824dd8a927124a4d73fa4b/work/docs" 2026-04-18 17:51:45.703327 | 2026-04-18 17:51:45.703461 | LOOP [fetch-output : Collect logs, artifacts and docs] 2026-04-18 17:51:46.372872 | controller | changed: .d..t...... ./ 2026-04-18 17:51:46.373137 | controller | changed: All items complete 2026-04-18 17:51:46.373177 | 2026-04-18 17:51:46.870940 | controller | changed: .d..t...... ./ 2026-04-18 17:51:47.382989 | controller | changed: .d..t...... ./ 2026-04-18 17:51:47.395002 | 2026-04-18 17:51:47.395137 | LOOP [merge-output-to-logs : Move artifacts and docs to logs dir] 2026-04-18 17:51:47.806829 | controller -> localhost | ok: Item: artifacts Runtime: 0:00:00.007644 2026-04-18 17:51:48.022126 | controller -> localhost | ok: Item: docs Runtime: 0:00:00.006235 2026-04-18 17:51:48.037302 | 2026-04-18 17:51:48.037435 | PLAY [all] 2026-04-18 17:51:48.044334 | 2026-04-18 17:51:48.044428 | TASK [remove-build-sshkey : Remove the build SSH key from all nodes] 2026-04-18 17:51:48.500101 | controller | changed 2026-04-18 17:51:48.512843 | 2026-04-18 17:51:48.512995 | PLAY RECAP 2026-04-18 17:51:48.513062 | controller | ok: 5 changed: 4 unreachable: 0 failed: 0 skipped: 1 rescued: 0 ignored: 0 2026-04-18 17:51:48.513095 | 2026-04-18 17:51:48.652402 | POST-RUN END RESULT_NORMAL: [trusted : github.com/vexxhost/zuul-config/playbooks/base/post.yaml@main] 2026-04-18 17:51:48.655292 | POST-RUN START: [trusted : github.com/vexxhost/zuul-config/playbooks/base/post-logs.yaml@main] 2026-04-18 17:51:49.242925 | 2026-04-18 17:51:49.243051 | PLAY [localhost] 2026-04-18 17:51:49.252874 | 2026-04-18 17:51:49.253094 | TASK [Generate Zuul manifest] 2026-04-18 17:51:49.274805 | localhost | ok 2026-04-18 17:51:49.293637 | 2026-04-18 17:51:49.293789 | TASK [generate-zuul-manifest : Generate Zuul manifest] 2026-04-18 17:51:49.646494 | localhost | changed 2026-04-18 17:51:49.672003 | 2026-04-18 17:51:49.672290 | TASK [generate-zuul-manifest : Return Zuul manifest URL to Zuul] 2026-04-18 17:51:49.704482 | localhost | ok 2026-04-18 17:51:49.714112 | 2026-04-18 17:51:49.714183 | TASK [Upload logs] 2026-04-18 17:51:49.734700 | localhost | ok 2026-04-18 17:51:49.792846 | 2026-04-18 17:51:49.793000 | TASK [Set zuul-log-path fact] 2026-04-18 17:51:49.829141 | localhost | ok 2026-04-18 17:51:49.840581 | 2026-04-18 17:51:49.840654 | TASK [set-zuul-log-path-fact : Set log path for a build] 2026-04-18 17:51:49.872807 | localhost | ok 2026-04-18 17:51:49.882484 | 2026-04-18 17:51:49.882579 | TASK [upload-logs : Create log directories] 2026-04-18 17:51:50.287564 | localhost | changed 2026-04-18 17:51:50.294317 | 2026-04-18 17:51:50.294408 | TASK [upload-logs : Ensure logs are readable before uploading] 2026-04-18 17:51:50.712693 | localhost -> localhost | ok: Runtime: 0:00:00.005909 2026-04-18 17:51:50.717617 | 2026-04-18 17:51:50.717681 | TASK [upload-logs : Upload logs to log server] 2026-04-18 17:51:51.210764 | localhost | Output suppressed because no_log was given 2026-04-18 17:51:51.214285 | 2026-04-18 17:51:51.214350 | LOOP [upload-logs : Compress console log and json output] 2026-04-18 17:51:51.258797 | localhost | skipping: Conditional result was False 2026-04-18 17:51:51.266309 | localhost | skipping: Conditional result was False 2026-04-18 17:51:51.278919 | 2026-04-18 17:51:51.279059 | LOOP [upload-logs : Upload compressed console log and json output] 2026-04-18 17:51:51.322705 | localhost | skipping: Conditional result was False 2026-04-18 17:51:51.323089 | 2026-04-18 17:51:51.327476 | localhost | skipping: Conditional result was False 2026-04-18 17:51:51.342373 | 2026-04-18 17:51:51.342516 | LOOP [upload-logs : Upload console log and json output]