2026-04-27 09:57:00.159253 | Job console starting 2026-04-27 09:57:00.250584 | Updating git repos 2026-04-27 09:57:00.464323 | Cloning repos into workspace 2026-04-27 09:57:00.548902 | Restoring repo states 2026-04-27 09:57:00.607882 | Merging changes 2026-04-27 09:57:02.045763 | Checking out repos 2026-04-27 09:57:02.232902 | Preparing playbooks 2026-04-27 09:57:11.779602 | Running Ansible setup 2026-04-27 09:57:15.573743 | PRE-RUN START: [trusted : github.com/vexxhost/zuul-config/playbooks/base/pre.yaml@main] 2026-04-27 09:57:16.184845 | 2026-04-27 09:57:16.185019 | PLAY [localhost] 2026-04-27 09:57:16.193158 | 2026-04-27 09:57:16.193257 | TASK [Gathering Facts] 2026-04-27 09:57:17.056510 | localhost | ok 2026-04-27 09:57:17.067048 | 2026-04-27 09:57:17.067152 | TASK [Setup log path fact] 2026-04-27 09:57:17.089661 | localhost | ok 2026-04-27 09:57:17.101708 | 2026-04-27 09:57:17.101783 | TASK [set-zuul-log-path-fact : Set log path for a build] 2026-04-27 09:57:17.130889 | localhost | ok 2026-04-27 09:57:17.139892 | 2026-04-27 09:57:17.139965 | TASK [emit-job-header : Print job information] 2026-04-27 09:57:17.182336 | # Job Information 2026-04-27 09:57:17.182596 | Ansible Version: 2.16.16 2026-04-27 09:57:17.182667 | Job: ansible-collection-kubernetes-molecule-helm 2026-04-27 09:57:17.182716 | Pipeline: check 2026-04-27 09:57:17.182761 | Executor: 0a8996d2b663 2026-04-27 09:57:17.182804 | Triggered by: https://github.com/vexxhost/ansible-collection-kubernetes/pull/270 2026-04-27 09:57:17.182852 | Event ID: 4dfcab60-421f-11f1-9da9-96d4948a245e 2026-04-27 09:57:17.187286 | 2026-04-27 09:57:17.187377 | LOOP [emit-job-header : Print node information] 2026-04-27 09:57:17.279816 | localhost | ok: 2026-04-27 09:57:17.430235 | localhost | # Node Information 2026-04-27 09:57:17.430410 | localhost | Inventory Hostname: controller 2026-04-27 09:57:17.430448 | localhost | Hostname: np0000170445 2026-04-27 09:57:17.430477 | localhost | Username: zuul 2026-04-27 09:57:17.430509 | localhost | Distro: Debian 13.4 2026-04-27 09:57:17.430537 | localhost | Provider: yul1 2026-04-27 09:57:17.430563 | localhost | Region: ca-ymq-1 2026-04-27 09:57:17.430589 | localhost | Label: debian-trixie 2026-04-27 09:57:17.430616 | localhost | Product Name: OpenStack Nova 2026-04-27 09:57:17.430642 | localhost | Interface IP: 199.19.213.194 2026-04-27 09:57:17.444849 | 2026-04-27 09:57:17.445090 | TASK [log-inventory : Ensure Zuul Ansible directory exists] 2026-04-27 09:57:17.847229 | localhost -> localhost | changed 2026-04-27 09:57:17.854584 | 2026-04-27 09:57:17.854703 | TASK [log-inventory : Copy ansible inventory to logs dir] 2026-04-27 09:57:18.753190 | localhost -> localhost | changed 2026-04-27 09:57:18.761250 | 2026-04-27 09:57:18.761331 | PLAY [all] 2026-04-27 09:57:18.784870 | 2026-04-27 09:57:18.785063 | TASK [add-build-sshkey : Check to see if ssh key was already created for this build] 2026-04-27 09:57:19.022413 | controller -> localhost | ok 2026-04-27 09:57:19.028493 | 2026-04-27 09:57:19.028566 | TASK [add-build-sshkey : Create a new key in workspace based on build UUID] 2026-04-27 09:57:19.057210 | controller | ok 2026-04-27 09:57:19.070007 | controller | included: /var/lib/zuul/builds/6a3c03fcbb314b30bab000973d5c09d4/trusted/project_1/opendev.org/zuul/zuul-jobs/roles/add-build-sshkey/tasks/create-key-and-replace.yaml 2026-04-27 09:57:19.074547 | 2026-04-27 09:57:19.074608 | TASK [add-build-sshkey : Create Temp SSH key] 2026-04-27 09:57:19.729493 | controller -> localhost | Generating public/private rsa key pair. 2026-04-27 09:57:19.729739 | controller -> localhost | Your identification has been saved in /var/lib/zuul/builds/6a3c03fcbb314b30bab000973d5c09d4/work/6a3c03fcbb314b30bab000973d5c09d4_id_rsa 2026-04-27 09:57:19.729776 | controller -> localhost | Your public key has been saved in /var/lib/zuul/builds/6a3c03fcbb314b30bab000973d5c09d4/work/6a3c03fcbb314b30bab000973d5c09d4_id_rsa.pub 2026-04-27 09:57:19.729804 | controller -> localhost | The key fingerprint is: 2026-04-27 09:57:19.729831 | controller -> localhost | SHA256:YrEKt6ZGsjiEM6YlbrWVMViyWyNqkqrIDpfDI0gc+TE zuul-build-sshkey 2026-04-27 09:57:19.729871 | controller -> localhost | The key's randomart image is: 2026-04-27 09:57:19.729897 | controller -> localhost | +---[RSA 3072]----+ 2026-04-27 09:57:19.729930 | controller -> localhost | | | 2026-04-27 09:57:19.729958 | controller -> localhost | | .. . | 2026-04-27 09:57:19.729981 | controller -> localhost | | o E= . | 2026-04-27 09:57:19.730002 | controller -> localhost | |. o+o= o | 2026-04-27 09:57:19.730023 | controller -> localhost | |.+o.= O S | 2026-04-27 09:57:19.730043 | controller -> localhost | |@*o* * . | 2026-04-27 09:57:19.730063 | controller -> localhost | |&OB * | 2026-04-27 09:57:19.730083 | controller -> localhost | |X=.* | 2026-04-27 09:57:19.730106 | controller -> localhost | |*=. | 2026-04-27 09:57:19.730127 | controller -> localhost | +----[SHA256]-----+ 2026-04-27 09:57:19.730179 | controller -> localhost | ok: Runtime: 0:00:00.234234 2026-04-27 09:57:19.734604 | 2026-04-27 09:57:19.734675 | TASK [add-build-sshkey : Remote setup ssh keys (linux)] 2026-04-27 09:57:19.766364 | controller | ok 2026-04-27 09:57:19.777193 | controller | included: /var/lib/zuul/builds/6a3c03fcbb314b30bab000973d5c09d4/trusted/project_1/opendev.org/zuul/zuul-jobs/roles/add-build-sshkey/tasks/remote-linux.yaml 2026-04-27 09:57:19.786575 | 2026-04-27 09:57:19.786704 | TASK [add-build-sshkey : Remove previously added zuul-build-sshkey] 2026-04-27 09:57:19.811885 | controller | skipping: Conditional result was False 2026-04-27 09:57:19.820751 | 2026-04-27 09:57:19.820901 | TASK [add-build-sshkey : Enable access via build key on all nodes] 2026-04-27 09:57:20.380704 | controller | changed 2026-04-27 09:57:20.385989 | 2026-04-27 09:57:20.386087 | TASK [add-build-sshkey : Make sure user has a .ssh] 2026-04-27 09:57:20.588384 | controller | ok 2026-04-27 09:57:20.634654 | 2026-04-27 09:57:20.634785 | TASK [add-build-sshkey : Install build private key as SSH key on all nodes] 2026-04-27 09:57:21.187836 | controller | changed 2026-04-27 09:57:21.192011 | 2026-04-27 09:57:21.192144 | TASK [add-build-sshkey : Install build public key as SSH key on all nodes] 2026-04-27 09:57:21.765830 | controller | changed 2026-04-27 09:57:21.865688 | 2026-04-27 09:57:21.865824 | TASK [add-build-sshkey : Remote setup ssh keys (windows)] 2026-04-27 09:57:21.891873 | controller | skipping: Conditional result was False 2026-04-27 09:57:21.899065 | 2026-04-27 09:57:21.899212 | TASK [remove-zuul-sshkey : Remove master key from local agent] 2026-04-27 09:57:22.361433 | controller -> localhost | changed 2026-04-27 09:57:22.370016 | 2026-04-27 09:57:22.370117 | TASK [add-build-sshkey : Add back temp key] 2026-04-27 09:57:22.703222 | controller -> localhost | Identity added: /var/lib/zuul/builds/6a3c03fcbb314b30bab000973d5c09d4/work/6a3c03fcbb314b30bab000973d5c09d4_id_rsa (zuul-build-sshkey) 2026-04-27 09:57:22.703443 | controller -> localhost | ok: Runtime: 0:00:00.019634 2026-04-27 09:57:22.707632 | 2026-04-27 09:57:22.707700 | TASK [add-build-sshkey : Verify we can still SSH to all nodes] 2026-04-27 09:57:23.046339 | controller | ok 2026-04-27 09:57:23.050155 | 2026-04-27 09:57:23.050217 | TASK [add-build-sshkey : Verify we can still SSH to all nodes (windows)] 2026-04-27 09:57:23.075987 | controller | skipping: Conditional result was False 2026-04-27 09:57:23.089184 | 2026-04-27 09:57:23.089249 | TASK [prepare-workspace : Start zuul_console daemon.] 2026-04-27 09:57:23.505128 | controller | ok 2026-04-27 09:57:23.512130 | 2026-04-27 09:57:23.512286 | TASK [prepare-workspace : Synchronize src repos to workspace directory.] 2026-04-27 09:57:24.526529 | controller | Output suppressed because no_log was given 2026-04-27 09:57:24.541163 | 2026-04-27 09:57:24.541260 | LOOP [ensure-output-dirs : Empty Zuul Output directories by removing them] 2026-04-27 09:57:24.760401 | controller | ok: "logs" 2026-04-27 09:57:24.760692 | controller | ok: All items complete 2026-04-27 09:57:24.760731 | 2026-04-27 09:57:24.944877 | controller | ok: "artifacts" 2026-04-27 09:57:25.131253 | controller | ok: "docs" 2026-04-27 09:57:25.143616 | 2026-04-27 09:57:25.143749 | LOOP [ensure-output-dirs : Ensure Zuul Output directories exist] 2026-04-27 09:57:25.354803 | controller | changed: "logs" 2026-04-27 09:57:25.544913 | controller | changed: "artifacts" 2026-04-27 09:57:25.746046 | controller | changed: "docs" 2026-04-27 09:57:25.755906 | 2026-04-27 09:57:25.756030 | PLAY RECAP 2026-04-27 09:57:25.756078 | controller | ok: 15 changed: 8 unreachable: 0 failed: 0 skipped: 3 rescued: 0 ignored: 0 2026-04-27 09:57:25.756107 | localhost | ok: 6 changed: 2 unreachable: 0 failed: 0 skipped: 0 rescued: 0 ignored: 0 2026-04-27 09:57:25.756130 | 2026-04-27 09:57:25.889192 | PRE-RUN END RESULT_NORMAL: [trusted : github.com/vexxhost/zuul-config/playbooks/base/pre.yaml@main] 2026-04-27 09:57:25.890545 | PRE-RUN START: [untrusted : github.com/vexxhost/zuul-jobs/playbooks/molecule/pre.yaml@main] 2026-04-27 09:57:26.518794 | 2026-04-27 09:57:26.518925 | PLAY [all] 2026-04-27 09:57:26.529609 | 2026-04-27 09:57:26.529701 | TASK [setup-uv : Extract archive] 2026-04-27 09:57:28.985236 | controller | changed 2026-04-27 09:57:28.992342 | 2026-04-27 09:57:28.992422 | TASK [setup-uv : Print version] 2026-04-27 09:57:28.779263 | controller | uv 0.8.13 2026-04-27 09:57:29.526818 | controller | ok: Runtime: 0:00:00.013320 2026-04-27 09:57:29.533224 | 2026-04-27 09:57:29.533282 | PLAY RECAP 2026-04-27 09:57:29.533354 | controller | ok: 2 changed: 2 unreachable: 0 failed: 0 skipped: 0 rescued: 0 ignored: 0 2026-04-27 09:57:29.533389 | 2026-04-27 09:57:29.649473 | PRE-RUN END RESULT_NORMAL: [untrusted : github.com/vexxhost/zuul-jobs/playbooks/molecule/pre.yaml@main] 2026-04-27 09:57:29.652147 | PRE-RUN START: [untrusted : github.com/vexxhost/ansible-collection-kubernetes/test-playbooks/molecule/pre.yml@main] 2026-04-27 09:57:30.217526 | 2026-04-27 09:57:30.217672 | PLAY [all] 2026-04-27 09:57:30.228282 | 2026-04-27 09:57:30.228392 | TASK [Update apt cache] 2026-04-27 09:57:35.691527 | controller | ok 2026-04-27 09:57:35.697758 | 2026-04-27 09:57:35.697862 | TASK [Disable firewalld] 2026-04-27 09:57:35.723253 | controller | skipping: Conditional result was False 2026-04-27 09:57:35.730198 | 2026-04-27 09:57:35.730326 | TASK [Install "jq" for log collection] 2026-04-27 09:57:38.178457 | controller | changed 2026-04-27 09:57:38.181124 | 2026-04-27 09:57:38.181194 | PLAY RECAP 2026-04-27 09:57:38.181256 | controller | ok: 2 changed: 1 unreachable: 0 failed: 0 skipped: 1 rescued: 0 ignored: 0 2026-04-27 09:57:38.181288 | 2026-04-27 09:57:38.307654 | PRE-RUN END RESULT_NORMAL: [untrusted : github.com/vexxhost/ansible-collection-kubernetes/test-playbooks/molecule/pre.yml@main] 2026-04-27 09:57:38.310308 | RUN START: [untrusted : github.com/vexxhost/zuul-jobs/playbooks/molecule/run.yaml@main] 2026-04-27 09:57:38.898421 | 2026-04-27 09:57:38.898567 | PLAY [all] 2026-04-27 09:57:38.908600 | 2026-04-27 09:57:38.908674 | TASK [Copy inventory file for Zuul] 2026-04-27 09:57:39.852986 | controller | changed 2026-04-27 09:57:39.860124 | 2026-04-27 09:57:39.860226 | TASK [Switch "ansible_host" to private IP] 2026-04-27 09:57:40.166471 | controller | changed: 1 replacements made 2026-04-27 09:57:40.172673 | 2026-04-27 09:57:40.172764 | TASK [Run Molecule scenario] 2026-04-27 09:57:40.007606 | controller | Using CPython 3.13.5 interpreter at: /usr/bin/python3 2026-04-27 09:57:40.007704 | controller | Creating virtual environment at: .venv 2026-04-27 09:57:41.194505 | controller | Downloading cryptography (4.3MiB) 2026-04-27 09:57:41.204842 | controller | Downloading pygments (1.2MiB) 2026-04-27 09:57:41.206187 | controller | Downloading ansible-core (2.3MiB) 2026-04-27 09:57:41.373241 | controller | Downloading cryptography 2026-04-27 09:57:41.420848 | controller | Downloading pygments 2026-04-27 09:57:41.608240 | controller | Downloading ansible-core 2026-04-27 09:57:41.657624 | controller | Installed 36 packages in 47ms 2026-04-27 09:57:42.327463 | controller | INFO Collection 'vexxhost.kubernetes' detected. 2026-04-27 09:57:42.327517 | controller | INFO Scenarios will be used from 'extensions/molecule' 2026-04-27 09:57:43.163752 | controller | CRITICAL 'extensions/molecule/default/molecule.yml' glob failed. Exiting. 2026-04-27 09:57:43.163804 | controller | INFO default scenario not found, disabling shared state. 2026-04-27 09:57:43.163909 | controller | INFO [helm > discovery] scenario test matrix: dependency, cleanup, destroy, syntax, create, prepare, converge, idempotence, side_effect, verify, cleanup, destroy 2026-04-27 09:57:43.164016 | controller | INFO [helm > prerun] Performing prerun with role_name_check=0... 2026-04-27 10:00:28.871957 | controller | INFO [helm > dependency] Executing 2026-04-27 10:00:28.872025 | controller | WARNING [helm > dependency] Missing roles requirements file: requirements.yml 2026-04-27 10:00:28.872035 | controller | WARNING [helm > dependency] Missing collections requirements file: collections.yml 2026-04-27 10:00:28.872067 | controller | WARNING [helm > dependency] Executed: 2 missing (Remove from test_sequence to suppress) 2026-04-27 10:00:28.877996 | controller | INFO [helm > cleanup] Executing 2026-04-27 10:00:28.878279 | controller | WARNING [helm > cleanup] Executed: Missing playbook (Remove from test_sequence to suppress) 2026-04-27 10:00:28.883503 | controller | INFO [helm > destroy] Executing 2026-04-27 10:00:28.883530 | controller | WARNING [helm > destroy] Skipping, '--destroy=never' requested. 2026-04-27 10:00:28.883594 | controller | INFO [helm > destroy] Executed: Successful 2026-04-27 10:00:28.888927 | controller | INFO [helm > syntax] Executing 2026-04-27 10:00:29.775092 | controller | 2026-04-27 10:00:29.775337 | controller | playbook: /home/zuul/src/github.com/vexxhost/ansible-collection-kubernetes/extensions/molecule/helm/converge.yml 2026-04-27 10:00:29.841159 | controller | INFO [helm > syntax] Executed: Successful 2026-04-27 10:00:29.852239 | controller | INFO [helm > create] Executing 2026-04-27 10:00:29.853726 | controller | WARNING [helm > create] Executed: Missing playbook (Remove from test_sequence to suppress) 2026-04-27 10:00:29.858950 | controller | INFO [helm > prepare] Executing 2026-04-27 10:00:30.709592 | controller | 2026-04-27 10:00:30.709750 | controller | PLAY [Prepare] ***************************************************************** 2026-04-27 10:00:30.709990 | controller | 2026-04-27 10:00:30.710205 | controller | TASK [Gathering Facts] ********************************************************* 2026-04-27 10:00:30.710351 | controller | Monday 27 April 2026 10:00:30 +0000 (0:00:00.028) 0:00:00.028 ********** 2026-04-27 10:00:31.974075 | 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-27 10:00:31.980903 | controller | ok: [controller] 2026-04-27 10:00:31.980954 | controller | 2026-04-27 10:00:31.981066 | controller | TASK [Install Debian packages] ************************************************* 2026-04-27 10:00:31.981193 | controller | Monday 27 April 2026 10:00:31 +0000 (0:00:01.272) 0:00:01.300 ********** 2026-04-27 10:00:33.392891 | controller | ok: [controller] 2026-04-27 10:00:33.392974 | controller | 2026-04-27 10:00:33.393151 | controller | PLAY RECAP ********************************************************************* 2026-04-27 10:00:33.393363 | controller | controller : ok=2 changed=0 unreachable=0 failed=0 skipped=0 rescued=0 ignored=0 2026-04-27 10:00:33.393532 | controller | 2026-04-27 10:00:33.393699 | controller | 2026-04-27 10:00:33.393885 | controller | TASKS RECAP ******************************************************************** 2026-04-27 10:00:33.394064 | controller | Monday 27 April 2026 10:00:33 +0000 (0:00:01.412) 0:00:02.713 ********** 2026-04-27 10:00:33.394242 | controller | =============================================================================== 2026-04-27 10:00:33.394426 | controller | Install Debian packages ------------------------------------------------- 1.41s 2026-04-27 10:00:33.394610 | controller | Gathering Facts --------------------------------------------------------- 1.27s 2026-04-27 10:00:33.501393 | controller | INFO [helm > prepare] Executed: Successful 2026-04-27 10:00:33.510739 | controller | INFO [helm > converge] Executing 2026-04-27 10:00:34.376166 | controller | 2026-04-27 10:00:34.376342 | controller | PLAY [Converge] **************************************************************** 2026-04-27 10:00:34.376461 | controller | 2026-04-27 10:00:34.376662 | controller | TASK [Gathering Facts] ********************************************************* 2026-04-27 10:00:34.376856 | controller | Monday 27 April 2026 10:00:34 +0000 (0:00:00.012) 0:00:00.012 ********** 2026-04-27 10:00:35.458004 | 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-27 10:00:35.463657 | controller | ok: [controller] 2026-04-27 10:00:35.463962 | controller | 2026-04-27 10:00:35.464180 | controller | TASK [vexxhost.containers.forget_package : Forget package] ********************* 2026-04-27 10:00:35.464377 | controller | Monday 27 April 2026 10:00:35 +0000 (0:00:01.087) 0:00:01.100 ********** 2026-04-27 10:00:35.956937 | controller | ok: [controller] 2026-04-27 10:00:35.957097 | controller | 2026-04-27 10:00:35.957434 | controller | TASK [vexxhost.containers.package : Update state for tar] ********************** 2026-04-27 10:00:35.957660 | controller | Monday 27 April 2026 10:00:35 +0000 (0:00:00.492) 0:00:01.593 ********** 2026-04-27 10:00:36.984300 | controller | ok: [controller] 2026-04-27 10:00:36.984482 | controller | 2026-04-27 10:00:36.984725 | controller | TASK [vexxhost.containers.directory : Create directory (/var/lib/downloads)] *** 2026-04-27 10:00:36.984949 | controller | Monday 27 April 2026 10:00:36 +0000 (0:00:01.027) 0:00:02.620 ********** 2026-04-27 10:00:37.404387 | controller | changed: [controller] 2026-04-27 10:00:37.404438 | controller | 2026-04-27 10:00:37.404506 | controller | TASK [vexxhost.containers.download_artifact : Starting download of file] ******* 2026-04-27 10:00:37.407829 | controller | Monday 27 April 2026 10:00:37 +0000 (0:00:00.418) 0:00:03.039 ********** 2026-04-27 10:00:37.454905 | controller | ok: [controller] => { 2026-04-27 10:00:37.455109 | controller | "msg": "https://get.helm.sh/helm-v3.11.2-linux-amd64.tar.gz" 2026-04-27 10:00:37.455292 | controller | } 2026-04-27 10:00:37.455466 | controller | 2026-04-27 10:00:37.455687 | controller | TASK [vexxhost.containers.download_artifact : Download item] ******************* 2026-04-27 10:00:37.455974 | controller | Monday 27 April 2026 10:00:37 +0000 (0:00:00.052) 0:00:03.091 ********** 2026-04-27 10:00:38.620302 | 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-27 10:00:38.631022 | controller | changed: [controller] 2026-04-27 10:00:38.631225 | controller | 2026-04-27 10:00:38.631433 | controller | TASK [vexxhost.containers.download_artifact : Extract archive] ***************** 2026-04-27 10:00:38.631623 | controller | Monday 27 April 2026 10:00:38 +0000 (0:00:01.176) 0:00:04.267 ********** 2026-04-27 10:00:40.679288 | controller | changed: [controller] 2026-04-27 10:00:40.679517 | controller | 2026-04-27 10:00:40.679784 | controller | TASK [vexxhost.kubernetes.helm : Remove Helm repository] *********************** 2026-04-27 10:00:40.680138 | controller | Monday 27 April 2026 10:00:40 +0000 (0:00:02.047) 0:00:06.315 ********** 2026-04-27 10:00:41.198144 | controller | ok: [controller] 2026-04-27 10:00:41.198169 | controller | 2026-04-27 10:00:41.198173 | controller | TASK [vexxhost.kubernetes.helm : Add bash autocomplete for helm] *************** 2026-04-27 10:00:41.198177 | controller | Monday 27 April 2026 10:00:41 +0000 (0:00:00.516) 0:00:06.832 ********** 2026-04-27 10:00:41.615217 | controller | changed: [controller] 2026-04-27 10:00:41.615278 | controller | 2026-04-27 10:00:41.615290 | controller | TASK [vexxhost.kubernetes.helm : Get Helm plugins dir] ************************* 2026-04-27 10:00:41.615298 | controller | Monday 27 April 2026 10:00:41 +0000 (0:00:00.417) 0:00:07.250 ********** 2026-04-27 10:00:42.099609 | controller | ok: [controller] 2026-04-27 10:00:42.099636 | controller | 2026-04-27 10:00:42.099641 | controller | TASK [vexxhost.kubernetes.helm : Create Helm plugins directory if it does not exist] *** 2026-04-27 10:00:42.099647 | controller | Monday 27 April 2026 10:00:42 +0000 (0:00:00.483) 0:00:07.733 ********** 2026-04-27 10:00:42.401475 | controller | changed: [controller] 2026-04-27 10:00:42.401659 | controller | 2026-04-27 10:00:42.401879 | controller | TASK [vexxhost.kubernetes.helm : Remove Helm diff plugin installed by kubernetes.core.helm_plugin] *** 2026-04-27 10:00:42.402084 | controller | Monday 27 April 2026 10:00:42 +0000 (0:00:00.304) 0:00:08.037 ********** 2026-04-27 10:00:42.700133 | controller | ok: [controller] 2026-04-27 10:00:42.700302 | controller | 2026-04-27 10:00:42.703830 | controller | TASK [Install plugin] ********************************************************** 2026-04-27 10:00:42.703850 | controller | Monday 27 April 2026 10:00:42 +0000 (0:00:00.298) 0:00:08.335 ********** 2026-04-27 10:00:42.757088 | controller | included: vexxhost.containers.download_artifact for controller 2026-04-27 10:00:42.757261 | controller | 2026-04-27 10:00:42.757457 | controller | TASK [vexxhost.containers.download_artifact : Starting download of file] ******* 2026-04-27 10:00:42.757644 | controller | Monday 27 April 2026 10:00:42 +0000 (0:00:00.057) 0:00:08.393 ********** 2026-04-27 10:00:42.809065 | controller | ok: [controller] => { 2026-04-27 10:00:42.809266 | controller | "msg": "https://github.com/databus23/helm-diff/releases/download/v3.8.1/helm-diff-linux-amd64.tgz" 2026-04-27 10:00:42.809442 | controller | } 2026-04-27 10:00:42.809605 | controller | 2026-04-27 10:00:42.809792 | controller | TASK [vexxhost.containers.download_artifact : Download item] ******************* 2026-04-27 10:00:42.809981 | controller | Monday 27 April 2026 10:00:42 +0000 (0:00:00.051) 0:00:08.445 ********** 2026-04-27 10:00:43.609665 | controller | changed: [controller] 2026-04-27 10:00:43.609939 | controller | 2026-04-27 10:00:43.610195 | controller | TASK [vexxhost.containers.download_artifact : Extract archive] ***************** 2026-04-27 10:00:43.610443 | controller | Monday 27 April 2026 10:00:43 +0000 (0:00:00.799) 0:00:09.245 ********** 2026-04-27 10:00:45.640661 | controller | changed: [controller] 2026-04-27 10:00:45.640947 | controller | 2026-04-27 10:00:45.641195 | controller | PLAY RECAP ********************************************************************* 2026-04-27 10:00:45.641479 | controller | controller : ok=16 changed=7 unreachable=0 failed=0 skipped=0 rescued=0 ignored=0 2026-04-27 10:00:45.641709 | controller | 2026-04-27 10:00:45.641932 | controller | 2026-04-27 10:00:45.642174 | controller | TASKS RECAP ******************************************************************** 2026-04-27 10:00:45.642448 | controller | Monday 27 April 2026 10:00:45 +0000 (0:00:02.030) 0:00:11.275 ********** 2026-04-27 10:00:45.642682 | controller | =============================================================================== 2026-04-27 10:00:45.642945 | controller | vexxhost.containers.download_artifact : Extract archive ----------------- 2.05s 2026-04-27 10:00:45.643198 | controller | vexxhost.containers.download_artifact : Extract archive ----------------- 2.03s 2026-04-27 10:00:45.643533 | controller | vexxhost.containers.download_artifact : Download item ------------------- 1.18s 2026-04-27 10:00:45.643882 | controller | Gathering Facts --------------------------------------------------------- 1.09s 2026-04-27 10:00:45.644181 | controller | vexxhost.containers.package : Update state for tar ---------------------- 1.03s 2026-04-27 10:00:45.644430 | controller | vexxhost.containers.download_artifact : Download item ------------------- 0.80s 2026-04-27 10:00:45.644678 | controller | vexxhost.kubernetes.helm : Remove Helm repository ----------------------- 0.52s 2026-04-27 10:00:45.644921 | controller | vexxhost.containers.forget_package : Forget package --------------------- 0.49s 2026-04-27 10:00:45.645168 | controller | vexxhost.kubernetes.helm : Get Helm plugins dir ------------------------- 0.48s 2026-04-27 10:00:45.645439 | controller | vexxhost.containers.directory : Create directory (/var/lib/downloads) --- 0.42s 2026-04-27 10:00:45.645725 | controller | vexxhost.kubernetes.helm : Add bash autocomplete for helm --------------- 0.42s 2026-04-27 10:00:45.645980 | controller | vexxhost.kubernetes.helm : Create Helm plugins directory if it does not exist --- 0.30s 2026-04-27 10:00:45.646235 | controller | vexxhost.kubernetes.helm : Remove Helm diff plugin installed by kubernetes.core.helm_plugin --- 0.30s 2026-04-27 10:00:45.646477 | controller | Install plugin ---------------------------------------------------------- 0.06s 2026-04-27 10:00:45.646723 | controller | vexxhost.containers.download_artifact : Starting download of file ------- 0.05s 2026-04-27 10:00:45.646969 | controller | vexxhost.containers.download_artifact : Starting download of file ------- 0.05s 2026-04-27 10:00:45.752736 | controller | INFO [helm > converge] Executed: Successful 2026-04-27 10:00:45.763147 | controller | INFO [helm > idempotence] Executing 2026-04-27 10:00:46.617568 | controller | 2026-04-27 10:00:46.617899 | controller | PLAY [Converge] **************************************************************** 2026-04-27 10:00:46.618133 | controller | 2026-04-27 10:00:46.618380 | controller | TASK [Gathering Facts] ********************************************************* 2026-04-27 10:00:46.618631 | controller | Monday 27 April 2026 10:00:46 +0000 (0:00:00.012) 0:00:00.012 ********** 2026-04-27 10:00:48.693290 | 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-27 10:00:48.699972 | controller | ok: [controller] 2026-04-27 10:00:48.700216 | controller | 2026-04-27 10:00:48.700469 | controller | TASK [vexxhost.containers.forget_package : Forget package] ********************* 2026-04-27 10:00:48.700713 | controller | Monday 27 April 2026 10:00:48 +0000 (0:00:02.082) 0:00:02.095 ********** 2026-04-27 10:00:49.155273 | controller | ok: [controller] 2026-04-27 10:00:49.155534 | controller | 2026-04-27 10:00:49.155787 | controller | TASK [vexxhost.containers.package : Update state for tar] ********************** 2026-04-27 10:00:49.156122 | controller | Monday 27 April 2026 10:00:49 +0000 (0:00:00.454) 0:00:02.549 ********** 2026-04-27 10:00:50.087774 | controller | ok: [controller] 2026-04-27 10:00:50.088134 | controller | 2026-04-27 10:00:50.088400 | controller | TASK [vexxhost.containers.directory : Create directory (/var/lib/downloads)] *** 2026-04-27 10:00:50.088646 | controller | Monday 27 April 2026 10:00:50 +0000 (0:00:00.932) 0:00:03.482 ********** 2026-04-27 10:00:50.487748 | controller | ok: [controller] 2026-04-27 10:00:50.488060 | controller | 2026-04-27 10:00:50.488316 | controller | TASK [vexxhost.containers.download_artifact : Starting download of file] ******* 2026-04-27 10:00:50.488565 | controller | Monday 27 April 2026 10:00:50 +0000 (0:00:00.400) 0:00:03.882 ********** 2026-04-27 10:00:50.538794 | controller | ok: [controller] => { 2026-04-27 10:00:50.539113 | controller | "msg": "https://get.helm.sh/helm-v3.11.2-linux-amd64.tar.gz" 2026-04-27 10:00:50.539375 | controller | } 2026-04-27 10:00:50.539617 | controller | 2026-04-27 10:00:50.539924 | controller | TASK [vexxhost.containers.download_artifact : Download item] ******************* 2026-04-27 10:00:50.540191 | controller | Monday 27 April 2026 10:00:50 +0000 (0:00:00.050) 0:00:03.933 ********** 2026-04-27 10:00:51.071681 | controller | ok: [controller] 2026-04-27 10:00:51.072017 | controller | 2026-04-27 10:00:51.072305 | controller | TASK [vexxhost.containers.download_artifact : Extract archive] ***************** 2026-04-27 10:00:51.072578 | controller | Monday 27 April 2026 10:00:51 +0000 (0:00:00.532) 0:00:04.466 ********** 2026-04-27 10:00:52.752518 | controller | ok: [controller] 2026-04-27 10:00:52.752569 | controller | 2026-04-27 10:00:52.752581 | controller | TASK [vexxhost.kubernetes.helm : Remove Helm repository] *********************** 2026-04-27 10:00:52.752590 | controller | Monday 27 April 2026 10:00:52 +0000 (0:00:01.679) 0:00:06.146 ********** 2026-04-27 10:00:53.240655 | controller | ok: [controller] 2026-04-27 10:00:53.240685 | controller | 2026-04-27 10:00:53.240691 | controller | TASK [vexxhost.kubernetes.helm : Add bash autocomplete for helm] *************** 2026-04-27 10:00:53.240696 | controller | Monday 27 April 2026 10:00:53 +0000 (0:00:00.486) 0:00:06.632 ********** 2026-04-27 10:00:53.660389 | controller | ok: [controller] 2026-04-27 10:00:53.660723 | controller | 2026-04-27 10:00:53.660998 | controller | TASK [vexxhost.kubernetes.helm : Get Helm plugins dir] ************************* 2026-04-27 10:00:53.661237 | controller | Monday 27 April 2026 10:00:53 +0000 (0:00:00.421) 0:00:07.054 ********** 2026-04-27 10:00:54.111504 | controller | ok: [controller] 2026-04-27 10:00:54.111556 | controller | 2026-04-27 10:00:54.111697 | controller | TASK [vexxhost.kubernetes.helm : Create Helm plugins directory if it does not exist] *** 2026-04-27 10:00:54.112873 | controller | Monday 27 April 2026 10:00:54 +0000 (0:00:00.448) 0:00:07.503 ********** 2026-04-27 10:00:54.416138 | controller | ok: [controller] 2026-04-27 10:00:54.416163 | controller | 2026-04-27 10:00:54.416168 | controller | TASK [vexxhost.kubernetes.helm : Remove Helm diff plugin installed by kubernetes.core.helm_plugin] *** 2026-04-27 10:00:54.416172 | controller | Monday 27 April 2026 10:00:54 +0000 (0:00:00.304) 0:00:07.807 ********** 2026-04-27 10:00:54.712916 | controller | ok: [controller] 2026-04-27 10:00:54.713050 | controller | 2026-04-27 10:00:54.713262 | controller | TASK [Install plugin] ********************************************************** 2026-04-27 10:00:54.713547 | controller | Monday 27 April 2026 10:00:54 +0000 (0:00:00.299) 0:00:08.107 ********** 2026-04-27 10:00:54.770898 | controller | included: vexxhost.containers.download_artifact for controller 2026-04-27 10:00:54.770934 | controller | 2026-04-27 10:00:54.771027 | controller | TASK [vexxhost.containers.download_artifact : Starting download of file] ******* 2026-04-27 10:00:54.771111 | controller | Monday 27 April 2026 10:00:54 +0000 (0:00:00.059) 0:00:08.166 ********** 2026-04-27 10:00:54.819104 | controller | ok: [controller] => { 2026-04-27 10:00:54.819165 | controller | "msg": "https://github.com/databus23/helm-diff/releases/download/v3.8.1/helm-diff-linux-amd64.tgz" 2026-04-27 10:00:54.819236 | controller | } 2026-04-27 10:00:54.819285 | controller | 2026-04-27 10:00:54.819395 | controller | TASK [vexxhost.containers.download_artifact : Download item] ******************* 2026-04-27 10:00:54.819480 | controller | Monday 27 April 2026 10:00:54 +0000 (0:00:00.048) 0:00:08.214 ********** 2026-04-27 10:00:55.253092 | controller | ok: [controller] 2026-04-27 10:00:55.253129 | controller | 2026-04-27 10:00:55.253138 | controller | TASK [vexxhost.containers.download_artifact : Extract archive] ***************** 2026-04-27 10:00:55.253146 | controller | Monday 27 April 2026 10:00:55 +0000 (0:00:00.430) 0:00:08.645 ********** 2026-04-27 10:00:56.869558 | controller | ok: [controller] 2026-04-27 10:00:56.869846 | controller | 2026-04-27 10:00:56.870108 | controller | PLAY RECAP ********************************************************************* 2026-04-27 10:00:56.870386 | controller | controller : ok=16 changed=0 unreachable=0 failed=0 skipped=0 rescued=0 ignored=0 2026-04-27 10:00:56.870656 | controller | 2026-04-27 10:00:56.870913 | controller | 2026-04-27 10:00:56.871183 | controller | TASKS RECAP ******************************************************************** 2026-04-27 10:00:56.871494 | controller | Monday 27 April 2026 10:00:56 +0000 (0:00:01.619) 0:00:10.264 ********** 2026-04-27 10:00:56.871866 | controller | =============================================================================== 2026-04-27 10:00:56.872271 | controller | Gathering Facts --------------------------------------------------------- 2.08s 2026-04-27 10:00:56.872517 | controller | vexxhost.containers.download_artifact : Extract archive ----------------- 1.68s 2026-04-27 10:00:56.872668 | controller | vexxhost.containers.download_artifact : Extract archive ----------------- 1.62s 2026-04-27 10:00:56.872817 | controller | vexxhost.containers.package : Update state for tar ---------------------- 0.93s 2026-04-27 10:00:56.872966 | controller | vexxhost.containers.download_artifact : Download item ------------------- 0.53s 2026-04-27 10:00:56.873118 | controller | vexxhost.kubernetes.helm : Remove Helm repository ----------------------- 0.49s 2026-04-27 10:00:56.873291 | controller | vexxhost.containers.forget_package : Forget package --------------------- 0.45s 2026-04-27 10:00:56.873442 | controller | vexxhost.kubernetes.helm : Get Helm plugins dir ------------------------- 0.45s 2026-04-27 10:00:56.873603 | controller | vexxhost.containers.download_artifact : Download item ------------------- 0.43s 2026-04-27 10:00:56.873766 | controller | vexxhost.kubernetes.helm : Add bash autocomplete for helm --------------- 0.42s 2026-04-27 10:00:56.873930 | controller | vexxhost.containers.directory : Create directory (/var/lib/downloads) --- 0.40s 2026-04-27 10:00:56.874087 | controller | vexxhost.kubernetes.helm : Create Helm plugins directory if it does not exist --- 0.30s 2026-04-27 10:00:56.874243 | controller | vexxhost.kubernetes.helm : Remove Helm diff plugin installed by kubernetes.core.helm_plugin --- 0.30s 2026-04-27 10:00:56.874390 | controller | Install plugin ---------------------------------------------------------- 0.06s 2026-04-27 10:00:56.874539 | controller | vexxhost.containers.download_artifact : Starting download of file ------- 0.05s 2026-04-27 10:00:56.874688 | controller | vexxhost.containers.download_artifact : Starting download of file ------- 0.05s 2026-04-27 10:00:56.973487 | controller | INFO [helm > idempotence] Executed: Successful 2026-04-27 10:00:56.979330 | controller | INFO [helm > side_effect] Executing 2026-04-27 10:00:56.979963 | controller | WARNING [helm > side_effect] Executed: Missing playbook (Remove from test_sequence to suppress) 2026-04-27 10:00:56.984899 | controller | INFO [helm > verify] Executing 2026-04-27 10:00:57.887489 | controller | 2026-04-27 10:00:57.887668 | controller | PLAY [Verify] ****************************************************************** 2026-04-27 10:00:57.887936 | controller | 2026-04-27 10:00:57.888103 | controller | TASK [Gathering Facts] ********************************************************* 2026-04-27 10:00:57.888290 | controller | Monday 27 April 2026 10:00:57 +0000 (0:00:00.010) 0:00:00.010 ********** 2026-04-27 10:00:58.946533 | 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-27 10:00:58.952410 | controller | ok: [controller] 2026-04-27 10:00:58.952556 | controller | 2026-04-27 10:00:58.952753 | controller | TASK [Get the current Helm version] ******************************************** 2026-04-27 10:00:58.952946 | controller | Monday 27 April 2026 10:00:58 +0000 (0:00:01.065) 0:00:01.075 ********** 2026-04-27 10:00:59.392164 | controller | changed: [controller] 2026-04-27 10:00:59.392270 | controller | 2026-04-27 10:00:59.392516 | controller | TASK [Assert Helm version] ***************************************************** 2026-04-27 10:00:59.392687 | controller | Monday 27 April 2026 10:00:59 +0000 (0:00:00.439) 0:00:01.514 ********** 2026-04-27 10:00:59.424508 | controller | ok: [controller] => { 2026-04-27 10:00:59.424665 | controller | "changed": false, 2026-04-27 10:00:59.424906 | controller | "msg": "All assertions passed" 2026-04-27 10:00:59.425042 | controller | } 2026-04-27 10:00:59.425268 | controller | 2026-04-27 10:00:59.425392 | controller | PLAY RECAP ********************************************************************* 2026-04-27 10:00:59.425898 | controller | controller : ok=3 changed=1 unreachable=0 failed=0 skipped=0 rescued=0 ignored=0 2026-04-27 10:00:59.426049 | controller | 2026-04-27 10:00:59.426294 | controller | 2026-04-27 10:00:59.426517 | controller | TASKS RECAP ******************************************************************** 2026-04-27 10:00:59.426680 | controller | Monday 27 April 2026 10:00:59 +0000 (0:00:00.033) 0:00:01.547 ********** 2026-04-27 10:00:59.426850 | controller | =============================================================================== 2026-04-27 10:00:59.427043 | controller | Gathering Facts --------------------------------------------------------- 1.07s 2026-04-27 10:00:59.427266 | controller | Get the current Helm version -------------------------------------------- 0.44s 2026-04-27 10:00:59.427463 | controller | Assert Helm version ----------------------------------------------------- 0.03s 2026-04-27 10:00:59.595523 | controller | INFO [helm > verify] Executed: Successful 2026-04-27 10:00:59.606263 | controller | INFO [helm > cleanup] Executing 2026-04-27 10:00:59.606571 | controller | WARNING [helm > cleanup] Executed: Missing playbook (Remove from test_sequence to suppress) 2026-04-27 10:00:59.611842 | controller | INFO [helm > destroy] Executing 2026-04-27 10:00:59.611863 | controller | WARNING [helm > destroy] Skipping, '--destroy=never' requested. 2026-04-27 10:00:59.611962 | controller | INFO [helm > destroy] Executed: Successful 2026-04-27 10:00:59.612242 | controller | WARNING Molecule executed 1 scenario (1 missing files) 2026-04-27 10:00:59.887733 | controller | ok: Runtime: 0:03:19.752720 2026-04-27 10:00:59.892880 | 2026-04-27 10:00:59.892974 | PLAY RECAP 2026-04-27 10:00:59.893046 | controller | ok: 3 changed: 3 unreachable: 0 failed: 0 skipped: 0 rescued: 0 ignored: 0 2026-04-27 10:00:59.893076 | 2026-04-27 10:01:00.042301 | RUN END RESULT_NORMAL: [untrusted : github.com/vexxhost/zuul-jobs/playbooks/molecule/run.yaml@main] 2026-04-27 10:01:00.045024 | POST-RUN START: [untrusted : github.com/vexxhost/ansible-collection-kubernetes/test-playbooks/molecule/post.yml@main] 2026-04-27 10:01:00.630248 | 2026-04-27 10:01:00.630423 | PLAY [all] 2026-04-27 10:01:00.642014 | 2026-04-27 10:01:00.642135 | TASK [describe-kubernetes-objects : creating directory for cluster scoped objects] 2026-04-27 10:01:01.019977 | controller | changed 2026-04-27 10:01:01.025972 | 2026-04-27 10:01:01.026119 | TASK [describe-kubernetes-objects : Gathering descriptions for cluster scoped objects] 2026-04-27 10:01:01.424360 | controller | xargs: warning: options --max-args and --replace/-I/-i are mutually exclusive, ignoring previous --max-args value 2026-04-27 10:01:01.424686 | controller | xargs: warning: options --max-args and --replace/-I/-i are mutually exclusive, ignoring previous --max-args value 2026-04-27 10:01:01.431501 | controller | environment: line 1: kubectl: command not found 2026-04-27 10:01:01.433467 | controller | xargs: warning: options --max-lines and --replace/-I/-i are mutually exclusive, ignoring previous --max-lines value 2026-04-27 10:01:01.434855 | controller | environment: line 1: kubectl: command not found 2026-04-27 10:01:01.435705 | controller | xargs: warning: options --max-lines and --replace/-I/-i are mutually exclusive, ignoring previous --max-lines value 2026-04-27 10:01:01.439434 | controller | environment: line 1: kubectl: command not found 2026-04-27 10:01:01.440486 | controller | environment: line 1: kubectl: command not found 2026-04-27 10:01:01.440813 | controller | xargs: warning: options --max-lines and --replace/-I/-i are mutually exclusive, ignoring previous --max-lines value 2026-04-27 10:01:01.441481 | controller | xargs: warning: options --max-lines and --replace/-I/-i are mutually exclusive, ignoring previous --max-lines value 2026-04-27 10:01:01.444351 | controller | environment: line 1: kubectl: command not found 2026-04-27 10:01:01.445624 | controller | xargs: warning: options --max-lines and --replace/-I/-i are mutually exclusive, ignoring previous --max-lines value 2026-04-27 10:01:01.556818 | controller | ok: Runtime: 0:00:00.033764 2026-04-27 10:01:01.564330 | 2026-04-27 10:01:01.564438 | TASK [describe-kubernetes-objects : creating directory for namespace scoped objects] 2026-04-27 10:01:01.788639 | controller | changed 2026-04-27 10:01:01.794143 | 2026-04-27 10:01:01.794246 | TASK [describe-kubernetes-objects : Gathering descriptions for namespace scoped objects] 2026-04-27 10:01:02.034757 | controller | environment: line 5: kubectl: command not found 2026-04-27 10:01:02.035854 | controller | xargs: warning: options --max-args and --replace/-I/-i are mutually exclusive, ignoring previous --max-args value 2026-04-27 10:01:02.036610 | controller | xargs: xargs: warning: options --max-args and --replace/-I/-i are mutually exclusive, ignoring previous --max-args valuewarning: options --max-args and --replace/-I/-i are mutually exclusive, ignoring previous --max-args value 2026-04-27 10:01:02.036636 | controller | 2026-04-27 10:01:02.324850 | controller | ok: Runtime: 0:00:00.012587 2026-04-27 10:01:02.332425 | 2026-04-27 10:01:02.332518 | TASK [describe-kubernetes-objects : Downloads logs to executor] 2026-04-27 10:01:03.009908 | controller | changed: 2026-04-27 10:01:03.010086 | controller | created directory /var/lib/zuul/builds/6a3c03fcbb314b30bab000973d5c09d4/work/logs/controller 2026-04-27 10:01:03.010117 | controller | cd+++++++++ objects/ 2026-04-27 10:01:03.010139 | controller | cd+++++++++ objects/cluster/ 2026-04-27 10:01:03.010163 | controller | cd+++++++++ objects/namespaced/ 2026-04-27 10:01:03.017192 | 2026-04-27 10:01:03.017258 | TASK [gather-pod-logs : creating directory for pod logs] 2026-04-27 10:01:03.252804 | controller | changed 2026-04-27 10:01:03.258403 | 2026-04-27 10:01:03.258470 | TASK [gather-pod-logs : creating directory for failed pod logs] 2026-04-27 10:01:03.493326 | controller | changed 2026-04-27 10:01:03.498842 | 2026-04-27 10:01:03.498944 | TASK [gather-pod-logs : retrieve all kubernetes logs, current and previous (if they exist)] 2026-04-27 10:01:03.742293 | controller | environment: line 3: kubectl: command not found 2026-04-27 10:01:04.031672 | controller | ok: Runtime: 0:00:00.012557 2026-04-27 10:01:04.038131 | 2026-04-27 10:01:04.038204 | TASK [gather-pod-logs : Downloads pod logs to executor] 2026-04-27 10:01:04.576688 | controller | changed: 2026-04-27 10:01:04.576880 | controller | cd+++++++++ pod-logs/ 2026-04-27 10:01:04.576919 | controller | cd+++++++++ pod-logs/failed-pods/ 2026-04-27 10:01:04.586218 | 2026-04-27 10:01:04.586309 | LOOP [helm-release-status : creating directory for helm release status] 2026-04-27 10:01:04.825631 | controller | changed: "values" 2026-04-27 10:01:05.020670 | controller | changed: "releases" 2026-04-27 10:01:05.039068 | 2026-04-27 10:01:05.039328 | TASK [helm-release-status : Gather get release status for helm charts] 2026-04-27 10:01:05.276022 | controller | /bin/bash: line 3: kubectl: command not found 2026-04-27 10:01:05.572296 | controller | ok: Runtime: 0:00:00.008516 2026-04-27 10:01:05.577981 | 2026-04-27 10:01:05.578071 | TASK [helm-release-status : Downloads logs to executor] 2026-04-27 10:01:06.125905 | controller | changed: 2026-04-27 10:01:06.126114 | controller | cd+++++++++ helm/ 2026-04-27 10:01:06.126152 | controller | cd+++++++++ helm/releases/ 2026-04-27 10:01:06.126184 | controller | cd+++++++++ helm/values/ 2026-04-27 10:01:06.132211 | 2026-04-27 10:01:06.132265 | PLAY RECAP 2026-04-27 10:01:06.132310 | controller | ok: 12 changed: 12 unreachable: 0 failed: 0 skipped: 0 rescued: 0 ignored: 0 2026-04-27 10:01:06.132332 | 2026-04-27 10:01:06.252430 | POST-RUN END RESULT_NORMAL: [untrusted : github.com/vexxhost/ansible-collection-kubernetes/test-playbooks/molecule/post.yml@main] 2026-04-27 10:01:06.255095 | POST-RUN START: [trusted : github.com/vexxhost/zuul-config/playbooks/base/post.yaml@main] 2026-04-27 10:01:06.825686 | 2026-04-27 10:01:06.825810 | PLAY [all] 2026-04-27 10:01:06.835773 | 2026-04-27 10:01:06.835849 | TASK [fetch-output : Set log path for multiple nodes] 2026-04-27 10:01:06.881388 | controller | skipping: Conditional result was False 2026-04-27 10:01:06.890136 | 2026-04-27 10:01:06.890427 | TASK [fetch-output : Set log path for single node] 2026-04-27 10:01:06.930798 | controller | ok 2026-04-27 10:01:06.936992 | 2026-04-27 10:01:06.937094 | LOOP [fetch-output : Ensure local output dirs] 2026-04-27 10:01:07.345377 | controller -> localhost | ok: "/var/lib/zuul/builds/6a3c03fcbb314b30bab000973d5c09d4/work/logs" 2026-04-27 10:01:07.547831 | controller -> localhost | changed: "/var/lib/zuul/builds/6a3c03fcbb314b30bab000973d5c09d4/work/artifacts" 2026-04-27 10:01:07.766591 | controller -> localhost | changed: "/var/lib/zuul/builds/6a3c03fcbb314b30bab000973d5c09d4/work/docs" 2026-04-27 10:01:07.782882 | 2026-04-27 10:01:07.783064 | LOOP [fetch-output : Collect logs, artifacts and docs] 2026-04-27 10:01:08.459210 | controller | changed: .d..t...... ./ 2026-04-27 10:01:08.459461 | controller | changed: All items complete 2026-04-27 10:01:08.459508 | 2026-04-27 10:01:08.941427 | controller | changed: .d..t...... ./ 2026-04-27 10:01:09.432693 | controller | changed: .d..t...... ./ 2026-04-27 10:01:09.450007 | 2026-04-27 10:01:09.450172 | LOOP [merge-output-to-logs : Move artifacts and docs to logs dir] 2026-04-27 10:01:09.879395 | controller -> localhost | ok: Item: artifacts Runtime: 0:00:00.006716 2026-04-27 10:01:10.121465 | controller -> localhost | ok: Item: docs Runtime: 0:00:00.008682 2026-04-27 10:01:10.134627 | 2026-04-27 10:01:10.134811 | PLAY [all] 2026-04-27 10:01:10.140622 | 2026-04-27 10:01:10.140692 | TASK [remove-build-sshkey : Remove the build SSH key from all nodes] 2026-04-27 10:01:10.636397 | controller | changed 2026-04-27 10:01:10.641924 | 2026-04-27 10:01:10.641977 | PLAY RECAP 2026-04-27 10:01:10.642024 | controller | ok: 5 changed: 4 unreachable: 0 failed: 0 skipped: 1 rescued: 0 ignored: 0 2026-04-27 10:01:10.642047 | 2026-04-27 10:01:10.762435 | POST-RUN END RESULT_NORMAL: [trusted : github.com/vexxhost/zuul-config/playbooks/base/post.yaml@main] 2026-04-27 10:01:10.765051 | POST-RUN START: [trusted : github.com/vexxhost/zuul-config/playbooks/base/post-logs.yaml@main] 2026-04-27 10:01:11.331410 | 2026-04-27 10:01:11.331590 | PLAY [localhost] 2026-04-27 10:01:11.342893 | 2026-04-27 10:01:11.343037 | TASK [Generate Zuul manifest] 2026-04-27 10:01:11.365514 | localhost | ok 2026-04-27 10:01:11.383878 | 2026-04-27 10:01:11.384021 | TASK [generate-zuul-manifest : Generate Zuul manifest] 2026-04-27 10:01:11.712759 | localhost | changed 2026-04-27 10:01:11.724398 | 2026-04-27 10:01:11.724496 | TASK [generate-zuul-manifest : Return Zuul manifest URL to Zuul] 2026-04-27 10:01:11.756040 | localhost | ok 2026-04-27 10:01:11.764326 | 2026-04-27 10:01:11.764392 | TASK [Upload logs] 2026-04-27 10:01:11.786158 | localhost | ok 2026-04-27 10:01:11.842507 | 2026-04-27 10:01:11.842611 | TASK [Set zuul-log-path fact] 2026-04-27 10:01:11.862307 | localhost | ok 2026-04-27 10:01:11.875508 | 2026-04-27 10:01:11.875580 | TASK [set-zuul-log-path-fact : Set log path for a build] 2026-04-27 10:01:11.906571 | localhost | ok 2026-04-27 10:01:11.915022 | 2026-04-27 10:01:11.915088 | TASK [upload-logs : Create log directories] 2026-04-27 10:01:12.314725 | localhost | changed 2026-04-27 10:01:12.321829 | 2026-04-27 10:01:12.321911 | TASK [upload-logs : Ensure logs are readable before uploading] 2026-04-27 10:01:12.722240 | localhost -> localhost | ok: Runtime: 0:00:00.005952 2026-04-27 10:01:12.728393 | 2026-04-27 10:01:12.728461 | TASK [upload-logs : Upload logs to log server] 2026-04-27 10:01:13.173621 | localhost | Output suppressed because no_log was given 2026-04-27 10:01:13.177987 | 2026-04-27 10:01:13.178136 | LOOP [upload-logs : Compress console log and json output] 2026-04-27 10:01:13.224680 | localhost | skipping: Conditional result was False 2026-04-27 10:01:13.231769 | localhost | skipping: Conditional result was False 2026-04-27 10:01:13.247140 | 2026-04-27 10:01:13.247288 | LOOP [upload-logs : Upload compressed console log and json output] 2026-04-27 10:01:13.290810 | localhost | skipping: Conditional result was False 2026-04-27 10:01:13.291187 | 2026-04-27 10:01:13.295123 | localhost | skipping: Conditional result was False 2026-04-27 10:01:13.312090 | 2026-04-27 10:01:13.312247 | LOOP [upload-logs : Upload console log and json output]