2026-07-30 16:44:47.338341 | Job console starting
2026-07-30 16:44:47.351278 | Updating git repos
2026-07-30 16:44:47.400658 | Cloning repos into workspace
2026-07-30 16:44:49.076791 | Restoring repo states
2026-07-30 16:44:49.099362 | Merging changes
2026-07-30 16:44:50.217193 | Checking out repos
2026-07-30 16:44:50.631268 | Preparing playbooks
2026-07-30 16:45:00.011348 | Running Ansible setup
2026-07-30 16:45:04.569070 | PRE-RUN START: [trusted : github.com/vexxhost/zuul-config/playbooks/base/pre.yaml@main]
2026-07-30 16:45:05.218164 | 
2026-07-30 16:45:05.218289 | PLAY [localhost]
2026-07-30 16:45:05.226294 | 
2026-07-30 16:45:05.226375 | TASK [Gathering Facts]
2026-07-30 16:45:06.154022 | localhost | ok
2026-07-30 16:45:06.160880 | 
2026-07-30 16:45:06.160984 | TASK [Setup log path fact]
2026-07-30 16:45:06.177879 | localhost | ok
2026-07-30 16:45:06.191630 | 
2026-07-30 16:45:06.191705 | TASK [set-zuul-log-path-fact : Set log path for a build]
2026-07-30 16:45:06.220429 | localhost | ok
2026-07-30 16:45:06.228233 | 
2026-07-30 16:45:06.228322 | TASK [emit-job-header : Print job information]
2026-07-30 16:45:06.268459 | # Job Information
2026-07-30 16:45:06.268610 | Ansible Version: 2.16.18
2026-07-30 16:45:06.268658 | Job: ansible-collection-kubernetes-molecule-upload-helm-chart
2026-07-30 16:45:06.268689 | Pipeline: check
2026-07-30 16:45:06.268718 | Executor: 2d72f0692154
2026-07-30 16:45:06.268745 | Triggered by: https://github.com/vexxhost/ansible-collection-kubernetes/pull/295
2026-07-30 16:45:06.268777 | Event ID: 5857cb20-8c35-11f1-928e-0ef560c33bf4
2026-07-30 16:45:06.272570 | 
2026-07-30 16:45:06.272662 | LOOP [emit-job-header : Print node information]
2026-07-30 16:45:06.356451 | localhost | ok:
2026-07-30 16:45:06.356986 | localhost | # Node Information
2026-07-30 16:45:06.357022 | localhost | Inventory Hostname: controller
2026-07-30 16:45:06.357045 | localhost | Hostname: np0000187557
2026-07-30 16:45:06.357066 | localhost | Username: zuul
2026-07-30 16:45:06.357090 | localhost | Distro: Debian 13.6
2026-07-30 16:45:06.357111 | localhost | Provider: yul1
2026-07-30 16:45:06.357131 | localhost | Region: ca-ymq-1
2026-07-30 16:45:06.357151 | localhost | Label: debian-trixie
2026-07-30 16:45:06.357170 | localhost | Product Name: OpenStack Nova
2026-07-30 16:45:06.357189 | localhost | Interface IP: 199.19.213.147
2026-07-30 16:45:06.369990 | 
2026-07-30 16:45:06.370143 | TASK [log-inventory : Ensure Zuul Ansible directory exists]
2026-07-30 16:45:06.770450 | localhost -> localhost | changed
2026-07-30 16:45:06.779327 | 
2026-07-30 16:45:06.779429 | TASK [log-inventory : Copy ansible inventory to logs dir]
2026-07-30 16:45:07.612513 | localhost -> localhost | changed
2026-07-30 16:45:07.619023 | 
2026-07-30 16:45:07.619079 | PLAY [all]
2026-07-30 16:45:07.630576 | 
2026-07-30 16:45:07.630649 | TASK [add-build-sshkey : Check to see if ssh key was already created for this build]
2026-07-30 16:45:07.847313 | controller -> localhost | ok
2026-07-30 16:45:07.857550 | 
2026-07-30 16:45:07.857661 | TASK [add-build-sshkey : Create a new key in workspace based on build UUID]
2026-07-30 16:45:07.887514 | controller | ok
2026-07-30 16:45:07.902332 | controller | included: /var/lib/zuul/builds/ec967d1569294684b4853a2ce66e8bf9/trusted/project_1/opendev.org/zuul/zuul-jobs/roles/add-build-sshkey/tasks/create-key-and-replace.yaml
2026-07-30 16:45:07.907365 | 
2026-07-30 16:45:07.907433 | TASK [add-build-sshkey : Create Temp SSH key]
2026-07-30 16:45:08.606084 | controller -> localhost | Generating public/private rsa key pair.
2026-07-30 16:45:08.606298 | controller -> localhost | Your identification has been saved in /var/lib/zuul/builds/ec967d1569294684b4853a2ce66e8bf9/work/ec967d1569294684b4853a2ce66e8bf9_id_rsa
2026-07-30 16:45:08.606344 | controller -> localhost | Your public key has been saved in /var/lib/zuul/builds/ec967d1569294684b4853a2ce66e8bf9/work/ec967d1569294684b4853a2ce66e8bf9_id_rsa.pub
2026-07-30 16:45:08.606379 | controller -> localhost | The key fingerprint is:
2026-07-30 16:45:08.606416 | controller -> localhost | SHA256:wVJwC9Lna9dFGDD5KNKJl6O0SnZGAx3I3xT29WswJaA zuul-build-sshkey
2026-07-30 16:45:08.606472 | controller -> localhost | The key's randomart image is:
2026-07-30 16:45:08.606512 | controller -> localhost | +---[RSA 3072]----+
2026-07-30 16:45:08.606554 | controller -> localhost | |   ..++o=.+++o.  |
2026-07-30 16:45:08.606590 | controller -> localhost | |    +.o*o+.o.+.  |
2026-07-30 16:45:08.606618 | controller -> localhost | |     o.BEo.oo..  |
2026-07-30 16:45:08.606647 | controller -> localhost | |      B.X.. .o.. |
2026-07-30 16:45:08.606675 | controller -> localhost | |     o *S+ . .o  |
2026-07-30 16:45:08.606703 | controller -> localhost | |    o = o . ..   |
2026-07-30 16:45:08.606730 | controller -> localhost | |   o + . .       |
2026-07-30 16:45:08.606757 | controller -> localhost | |    .            |
2026-07-30 16:45:08.606789 | controller -> localhost | |                 |
2026-07-30 16:45:08.606817 | controller -> localhost | +----[SHA256]-----+
2026-07-30 16:45:08.606882 | controller -> localhost | ok: Runtime: 0:00:00.272655
2026-07-30 16:45:08.612991 | 
2026-07-30 16:45:08.613103 | TASK [add-build-sshkey : Remote setup ssh keys (linux)]
2026-07-30 16:45:08.645708 | controller | ok
2026-07-30 16:45:08.655611 | controller | included: /var/lib/zuul/builds/ec967d1569294684b4853a2ce66e8bf9/trusted/project_1/opendev.org/zuul/zuul-jobs/roles/add-build-sshkey/tasks/remote-linux.yaml
2026-07-30 16:45:08.661981 | 
2026-07-30 16:45:08.662077 | TASK [add-build-sshkey : Remove previously added zuul-build-sshkey]
2026-07-30 16:45:08.686176 | controller | skipping: Conditional result was False
2026-07-30 16:45:08.695756 | 
2026-07-30 16:45:08.695941 | TASK [add-build-sshkey : Enable access via build key on all nodes]
2026-07-30 16:45:09.235861 | controller | changed
2026-07-30 16:45:09.323396 | 
2026-07-30 16:45:09.323559 | TASK [add-build-sshkey : Make sure user has a .ssh]
2026-07-30 16:45:09.525835 | controller | ok
2026-07-30 16:45:09.530162 | 
2026-07-30 16:45:09.530229 | TASK [add-build-sshkey : Install build private key as SSH key on all nodes]
2026-07-30 16:45:10.077990 | controller | changed
2026-07-30 16:45:10.084084 | 
2026-07-30 16:45:10.084147 | TASK [add-build-sshkey : Install build public key as SSH key on all nodes]
2026-07-30 16:45:10.613802 | controller | changed
2026-07-30 16:45:10.617956 | 
2026-07-30 16:45:10.618021 | TASK [add-build-sshkey : Remote setup ssh keys (windows)]
2026-07-30 16:45:10.642282 | controller | skipping: Conditional result was False
2026-07-30 16:45:10.648414 | 
2026-07-30 16:45:10.648486 | TASK [remove-zuul-sshkey : Remove master key from local agent]
2026-07-30 16:45:11.006280 | controller -> localhost | changed
2026-07-30 16:45:11.036876 | 
2026-07-30 16:45:11.037019 | TASK [add-build-sshkey : Add back temp key]
2026-07-30 16:45:11.330787 | controller -> localhost | Identity added: /var/lib/zuul/builds/ec967d1569294684b4853a2ce66e8bf9/work/ec967d1569294684b4853a2ce66e8bf9_id_rsa (zuul-build-sshkey)
2026-07-30 16:45:11.331262 | controller -> localhost | ok: Runtime: 0:00:00.016365
2026-07-30 16:45:11.340093 | 
2026-07-30 16:45:11.340166 | TASK [add-build-sshkey : Verify we can still SSH to all nodes]
2026-07-30 16:45:11.665588 | controller | ok
2026-07-30 16:45:11.670722 | 
2026-07-30 16:45:11.670790 | TASK [add-build-sshkey : Verify we can still SSH to all nodes (windows)]
2026-07-30 16:45:11.694997 | controller | skipping: Conditional result was False
2026-07-30 16:45:11.710507 | 
2026-07-30 16:45:11.710593 | TASK [prepare-workspace : Start zuul_console daemon.]
2026-07-30 16:45:12.045708 | controller | ok
2026-07-30 16:45:12.058294 | 
2026-07-30 16:45:12.058356 | TASK [prepare-workspace : Synchronize src repos to workspace directory.]
2026-07-30 16:45:13.013370 | controller | Output suppressed because no_log was given
2026-07-30 16:45:13.023598 | 
2026-07-30 16:45:13.023663 | LOOP [ensure-output-dirs : Empty Zuul Output directories by removing them]
2026-07-30 16:45:13.254142 | controller | ok: "logs"
2026-07-30 16:45:13.254394 | controller | ok: All items complete
2026-07-30 16:45:13.254442 | 
2026-07-30 16:45:13.436971 | controller | ok: "artifacts"
2026-07-30 16:45:13.607475 | controller | ok: "docs"
2026-07-30 16:45:13.619080 | 
2026-07-30 16:45:13.619191 | LOOP [ensure-output-dirs : Ensure Zuul Output directories exist]
2026-07-30 16:45:13.826431 | controller | changed: "logs"
2026-07-30 16:45:14.010098 | controller | changed: "artifacts"
2026-07-30 16:45:14.204690 | controller | changed: "docs"
2026-07-30 16:45:14.215314 | 
2026-07-30 16:45:14.215427 | PLAY RECAP
2026-07-30 16:45:14.215489 | controller | ok: 15 changed: 8 unreachable: 0 failed: 0 skipped: 3 rescued: 0 ignored: 0
2026-07-30 16:45:14.215528 | localhost | ok: 6 changed: 2 unreachable: 0 failed: 0 skipped: 0 rescued: 0 ignored: 0
2026-07-30 16:45:14.215559 | 
2026-07-30 16:45:14.326985 | PRE-RUN END RESULT_NORMAL: [trusted : github.com/vexxhost/zuul-config/playbooks/base/pre.yaml@main]
2026-07-30 16:45:14.329198 | PRE-RUN START: [untrusted : github.com/vexxhost/zuul-jobs/playbooks/molecule/pre.yaml@main]
2026-07-30 16:45:14.916913 | 
2026-07-30 16:45:14.917045 | PLAY [all]
2026-07-30 16:45:14.926429 | 
2026-07-30 16:45:14.926513 | TASK [setup-uv : Extract archive]
2026-07-30 16:45:17.290074 | controller | changed
2026-07-30 16:45:17.296759 | 
2026-07-30 16:45:17.296870 | TASK [setup-uv : Print version]
2026-07-30 16:45:17.647930 | controller | uv 0.8.13
2026-07-30 16:45:17.828583 | controller | ok: Runtime: 0:00:00.014809
2026-07-30 16:45:17.839253 | 
2026-07-30 16:45:17.839343 | TASK [Install Ansible collection siblings]
2026-07-30 16:45:18.227096 | controller | ok:
2026-07-30 16:45:18.227285 | controller | Skipping ansible.posix: no checked-out sibling
2026-07-30 16:45:18.227325 | controller | Skipping community.crypto: no checked-out sibling
2026-07-30 16:45:18.227355 | controller | Skipping community.general: no checked-out sibling
2026-07-30 16:45:18.227384 | controller | Skipping kubernetes.core: no checked-out sibling
2026-07-30 16:45:18.227411 | controller | Skipping vexxhost.containers: no checked-out sibling
2026-07-30 16:45:18.229564 | 
2026-07-30 16:45:18.229628 | PLAY RECAP
2026-07-30 16:45:18.229690 | controller | ok: 3 changed: 2 unreachable: 0 failed: 0 skipped: 0 rescued: 0 ignored: 0
2026-07-30 16:45:18.229719 | 
2026-07-30 16:45:18.349020 | PRE-RUN END RESULT_NORMAL: [untrusted : github.com/vexxhost/zuul-jobs/playbooks/molecule/pre.yaml@main]
2026-07-30 16:45:18.351997 | PRE-RUN START: [untrusted : github.com/vexxhost/ansible-collection-kubernetes/test-playbooks/molecule/pre.yml@main]
2026-07-30 16:45:18.930634 | 
2026-07-30 16:45:19.939237 | PLAY [all]
2026-07-30 16:45:19.957827 | 
2026-07-30 16:45:19.958136 | TASK [Update apt cache]
2026-07-30 16:45:24.891128 | controller | ok
2026-07-30 16:45:24.898103 | 
2026-07-30 16:45:24.898232 | TASK [Disable firewalld]
2026-07-30 16:45:24.924750 | controller | skipping: Conditional result was False
2026-07-30 16:45:24.933933 | 
2026-07-30 16:45:24.934095 | TASK [Install "jq" for log collection]
2026-07-30 16:45:27.290260 | controller | changed
2026-07-30 16:45:27.292699 | 
2026-07-30 16:45:27.292754 | PLAY RECAP
2026-07-30 16:45:27.292806 | controller | ok: 2 changed: 1 unreachable: 0 failed: 0 skipped: 1 rescued: 0 ignored: 0
2026-07-30 16:45:27.292829 | 
2026-07-30 16:45:27.455227 | PRE-RUN END RESULT_NORMAL: [untrusted : github.com/vexxhost/ansible-collection-kubernetes/test-playbooks/molecule/pre.yml@main]
2026-07-30 16:45:27.458134 | RUN START: [untrusted : github.com/vexxhost/zuul-jobs/playbooks/molecule/run.yaml@main]
2026-07-30 16:45:28.099981 | 
2026-07-30 16:45:28.100131 | PLAY [all]
2026-07-30 16:45:28.111381 | 
2026-07-30 16:45:28.111454 | LOOP [Check inventory directories]
2026-07-30 16:45:28.472247 | controller | ok: "src/github.com/vexxhost/ansible-collection-kubernetes"
2026-07-30 16:45:28.652229 | controller | ok: "src/github.com/vexxhost/ansible-collection-kubernetes/molecule/upload-helm-chart/inventory"
2026-07-30 16:45:28.829754 | controller | ok: "src/github.com/vexxhost/ansible-collection-kubernetes/extensions/molecule/upload-helm-chart/inventory"
2026-07-30 16:45:28.847032 | 
2026-07-30 16:45:28.847212 | LOOP [Copy inventory file for Zuul]
2026-07-30 16:45:29.719704 | controller | changed:
2026-07-30 16:45:29.719960 | controller | {
2026-07-30 16:45:29.719999 | controller |   "ansible_loop_var": "item",
2026-07-30 16:45:29.720031 | controller |   "changed": false,
2026-07-30 16:45:29.720059 | controller |   "failed": false,
2026-07-30 16:45:29.720091 | controller |   "invocation": {
2026-07-30 16:45:29.720117 | controller |     "module_args": {
2026-07-30 16:45:29.720143 | controller |       "checksum_algorithm": "sha1",
2026-07-30 16:45:29.720168 | controller |       "follow": true,
2026-07-30 16:45:29.720194 | controller |       "get_attributes": true,
2026-07-30 16:45:29.720220 | controller |       "get_checksum": true,
2026-07-30 16:45:29.720245 | controller |       "get_mime": true,
2026-07-30 16:45:29.720269 | controller |       "path": "src/github.com/vexxhost/ansible-collection-kubernetes"
2026-07-30 16:45:29.720293 | controller |     }
2026-07-30 16:45:29.720316 | controller |   },
2026-07-30 16:45:29.720340 | controller |   "item": "src/github.com/vexxhost/ansible-collection-kubernetes",
2026-07-30 16:45:29.720364 | controller |   "stat": {
2026-07-30 16:45:29.720388 | controller |     "atime": 1785429912.8967755,
2026-07-30 16:45:29.720413 | controller |     "attr_flags": "e",
2026-07-30 16:45:29.720438 | controller |     "attributes": [
2026-07-30 16:45:29.720462 | controller |       "extents"
2026-07-30 16:45:29.720486 | controller |     ],
2026-07-30 16:45:29.720510 | controller |     "block_size": 4096,
2026-07-30 16:45:29.720534 | controller |     "blocks": 8,
2026-07-30 16:45:29.720558 | controller |     "charset": "unknown",
2026-07-30 16:45:29.720584 | controller |     "ctime": 1785429912.9167755,
2026-07-30 16:45:29.720609 | controller |     "dev": 65025,
2026-07-30 16:45:29.720634 | controller |     "device_type": 0,
2026-07-30 16:45:29.720658 | controller |     "executable": true,
2026-07-30 16:45:29.720682 | controller |     "exists": true,
2026-07-30 16:45:29.720706 | controller |     "gid": 1000,
2026-07-30 16:45:29.720730 | controller |     "gr_name": "zuul",
2026-07-30 16:45:29.720754 | controller |     "inode": 518935,
2026-07-30 16:45:29.720777 | controller |     "isblk": false,
2026-07-30 16:45:29.720801 | controller |     "ischr": false,
2026-07-30 16:45:29.720825 | controller |     "isdir": true,
2026-07-30 16:45:29.720849 | controller |     "isfifo": false,
2026-07-30 16:45:29.720872 | controller |     "isgid": false,
2026-07-30 16:45:29.720895 | controller |     "islnk": false,
2026-07-30 16:45:29.720918 | controller |     "isreg": false,
2026-07-30 16:45:29.720942 | controller |     "issock": false,
2026-07-30 16:45:29.720989 | controller |     "isuid": false,
2026-07-30 16:45:29.721015 | controller |     "mimetype": "unknown",
2026-07-30 16:45:29.721038 | controller |     "mode": "0755",
2026-07-30 16:45:29.721062 | controller |     "mtime": 1785429889.9441245,
2026-07-30 16:45:29.721085 | controller |     "nlink": 14,
2026-07-30 16:45:29.721108 | controller |     "path": "src/github.com/vexxhost/ansible-collection-kubernetes",
2026-07-30 16:45:29.721132 | controller |     "pw_name": "zuul",
2026-07-30 16:45:29.721156 | controller |     "readable": true,
2026-07-30 16:45:29.721180 | controller |     "rgrp": true,
2026-07-30 16:45:29.721217 | controller |     "roth": true,
2026-07-30 16:45:29.721243 | controller |     "rusr": true,
2026-07-30 16:45:29.721267 | controller |     "size": 4096,
2026-07-30 16:45:29.721290 | controller |     "uid": 1000,
2026-07-30 16:45:29.721314 | controller |     "version": "2596576885",
2026-07-30 16:45:29.721338 | controller |     "wgrp": false,
2026-07-30 16:45:29.721364 | controller |     "woth": false,
2026-07-30 16:45:29.721388 | controller |     "writeable": true,
2026-07-30 16:45:29.721412 | controller |     "wusr": true,
2026-07-30 16:45:29.721435 | controller |     "xgrp": true,
2026-07-30 16:45:29.721458 | controller |     "xoth": true,
2026-07-30 16:45:29.721481 | controller |     "xusr": true
2026-07-30 16:45:29.721520 | controller |   }
2026-07-30 16:45:29.721546 | controller | }
2026-07-30 16:45:29.721595 | controller | ok: All items complete
2026-07-30 16:45:29.721635 | 
2026-07-30 16:45:29.723538 | controller | skipping: Conditional result was False
2026-07-30 16:45:29.724493 | controller | skipping: Conditional result was False
2026-07-30 16:45:29.741467 | 
2026-07-30 16:45:29.741624 | LOOP [Switch "ansible_host" to private IP]
2026-07-30 16:45:30.106514 | controller | changed: 1 replacements made
2026-07-30 16:45:30.108526 | controller | skipping: Conditional result was False
2026-07-30 16:45:30.109815 | controller | skipping: Conditional result was False
2026-07-30 16:45:30.121896 | 
2026-07-30 16:45:30.122070 | TASK [Run Molecule scenario]
2026-07-30 16:45:30.564608 | controller | Using CPython 3.13.5 interpreter at: /usr/bin/python3
2026-07-30 16:45:30.564734 | controller | Creating virtual environment at: .venv
2026-07-30 16:45:30.848474 | controller | Downloading pygments (1.2MiB)
2026-07-30 16:45:30.848669 | controller | Downloading ansible-core (2.3MiB)
2026-07-30 16:45:30.848891 | controller | Downloading cryptography (4.3MiB)
2026-07-30 16:45:31.008572 | controller |  Downloading cryptography
2026-07-30 16:45:31.071961 | controller |  Downloading pygments
2026-07-30 16:45:31.222818 | controller |  Downloading ansible-core
2026-07-30 16:45:31.269352 | controller | Installed 36 packages in 45ms
2026-07-30 16:45:31.974346 | controller | INFO     Collection 'vexxhost.kubernetes' detected.
2026-07-30 16:45:31.974436 | controller | INFO     Scenarios will be used from 'extensions/molecule'
2026-07-30 16:45:32.847602 | controller | CRITICAL 'extensions/molecule/default/molecule.yml' glob failed.  Exiting.
2026-07-30 16:45:32.847658 | controller | INFO     default scenario not found, disabling shared state.
2026-07-30 16:45:32.847677 | controller | INFO     [upload-helm-chart > discovery] scenario test matrix: dependency, cleanup, destroy, syntax, create, prepare, converge, idempotence, side_effect, verify, cleanup, destroy
2026-07-30 16:45:32.847765 | controller | INFO     [upload-helm-chart > prerun] Performing prerun with role_name_check=0...
2026-07-30 16:46:17.106930 | controller | INFO     [upload-helm-chart > dependency] Executing
2026-07-30 16:46:17.107039 | controller | WARNING  [upload-helm-chart > dependency] Missing roles requirements file: requirements.yml
2026-07-30 16:46:17.107051 | controller | WARNING  [upload-helm-chart > dependency] Missing collections requirements file: collections.yml
2026-07-30 16:46:17.107086 | controller | WARNING  [upload-helm-chart > dependency] Executed: 2 missing (Remove from test_sequence to suppress)
2026-07-30 16:46:17.114617 | controller | INFO     [upload-helm-chart > cleanup] Executing
2026-07-30 16:46:17.115182 | controller | WARNING  [upload-helm-chart > cleanup] Executed: Missing playbook (Remove from test_sequence to suppress)
2026-07-30 16:46:17.121405 | controller | INFO     [upload-helm-chart > destroy] Executing
2026-07-30 16:46:17.121430 | controller | WARNING  [upload-helm-chart > destroy] Skipping, '--destroy=never' requested.
2026-07-30 16:46:17.121445 | controller | INFO     [upload-helm-chart > destroy] Executed: Successful
2026-07-30 16:46:17.126827 | controller | INFO     [upload-helm-chart > syntax] Executing
2026-07-30 16:46:18.022444 | controller |
2026-07-30 16:46:18.022669 | controller | playbook: /home/zuul/src/github.com/vexxhost/ansible-collection-kubernetes/extensions/molecule/upload-helm-chart/converge.yml
2026-07-30 16:46:18.105419 | controller | INFO     [upload-helm-chart > syntax] Executed: Successful
2026-07-30 16:46:18.116144 | controller | INFO     [upload-helm-chart > create] Executing
2026-07-30 16:46:18.118392 | controller | WARNING  [upload-helm-chart > create] Executed: Missing playbook (Remove from test_sequence to suppress)
2026-07-30 16:46:18.125234 | controller | INFO     [upload-helm-chart > prepare] Executing
2026-07-30 16:46:18.125505 | controller | WARNING  [upload-helm-chart > prepare] Executed: Missing playbook (Remove from test_sequence to suppress)
2026-07-30 16:46:18.130853 | controller | INFO     [upload-helm-chart > converge] Executing
2026-07-30 16:46:19.004026 | controller |
2026-07-30 16:46:19.004091 | controller | PLAY [Converge] ****************************************************************
2026-07-30 16:46:19.004188 | controller |
2026-07-30 16:46:19.004321 | controller | TASK [Gathering Facts] *********************************************************
2026-07-30 16:46:19.004480 | controller | Thursday 30 July 2026  16:46:19 +0000 (0:00:00.033)       0:00:00.033 *********
2026-07-30 16:46:20.231011 | 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-07-30 16:46:20.237707 | controller | ok: [controller]
2026-07-30 16:46:20.237884 | controller |
2026-07-30 16:46:20.238093 | controller | TASK [vexxhost.kubernetes.upload_helm_chart : Include help chart upload method tasks] ***
2026-07-30 16:46:20.238294 | controller | Thursday 30 July 2026  16:46:20 +0000 (0:00:01.232)       0:00:01.265 *********
2026-07-30 16:46:20.326436 | controller | included: /home/zuul/.ansible/collections/ansible_collections/vexxhost/kubernetes/roles/upload_helm_chart/tasks/synchronize.yml for controller
2026-07-30 16:46:20.326597 | controller |
2026-07-30 16:46:20.326826 | controller | TASK [vexxhost.kubernetes.upload_helm_chart : Upload Helm chart] ***************
2026-07-30 16:46:20.327058 | controller | Thursday 30 July 2026  16:46:20 +0000 (0:00:00.090)       0:00:01.356 *********
2026-07-30 16:46:20.957961 | controller | changed: [controller]
2026-07-30 16:46:20.958142 | controller |
2026-07-30 16:46:20.958358 | controller | TASK [vexxhost.kubernetes.upload_helm_chart : Include help chart upload method tasks] ***
2026-07-30 16:46:20.958606 | controller | Thursday 30 July 2026  16:46:20 +0000 (0:00:00.631)       0:00:01.987 *********
2026-07-30 16:46:21.018703 | controller | included: /home/zuul/.ansible/collections/ansible_collections/vexxhost/kubernetes/roles/upload_helm_chart/tasks/copy.yml for controller
2026-07-30 16:46:21.018757 | controller |
2026-07-30 16:46:21.018913 | controller | TASK [vexxhost.kubernetes.upload_helm_chart : Ensure destination dir] **********
2026-07-30 16:46:21.019134 | controller | Thursday 30 July 2026  16:46:21 +0000 (0:00:00.058)       0:00:02.045 *********
2026-07-30 16:46:21.452610 | controller | changed: [controller]
2026-07-30 16:46:21.452643 | controller |
2026-07-30 16:46:21.452651 | controller | TASK [vexxhost.kubernetes.upload_helm_chart : Upload helm chart with multi_copy] ***
2026-07-30 16:46:21.452657 | controller | Thursday 30 July 2026  16:46:21 +0000 (0:00:00.433)       0:00:02.479 *********
2026-07-30 16:46:22.587151 | controller | changed: [controller]
2026-07-30 16:46:22.587211 | controller |
2026-07-30 16:46:22.587274 | controller | TASK [vexxhost.kubernetes.upload_helm_chart : Find destination files] **********
2026-07-30 16:46:22.587354 | controller | Thursday 30 July 2026  16:46:22 +0000 (0:00:01.133)       0:00:03.612 *********
2026-07-30 16:46:23.004148 | controller | ok: [controller]
2026-07-30 16:46:23.004301 | controller |
2026-07-30 16:46:23.004536 | controller | TASK [vexxhost.kubernetes.upload_helm_chart : Delete any destination files not in the sources] ***
2026-07-30 16:46:23.004788 | controller | Thursday 30 July 2026  16:46:23 +0000 (0:00:00.420)       0:00:04.033 *********
2026-07-30 16:46:23.060118 | controller | skipping: [controller]
2026-07-30 16:46:23.060245 | controller |
2026-07-30 16:46:23.060435 | controller | PLAY RECAP *********************************************************************
2026-07-30 16:46:23.060702 | controller | controller                 : ok=7    changed=3    unreachable=0    failed=0    skipped=1    rescued=0    ignored=0
2026-07-30 16:46:23.060875 | controller |
2026-07-30 16:46:23.061035 | controller |
2026-07-30 16:46:23.061220 | controller | TASKS RECAP ********************************************************************
2026-07-30 16:46:23.061409 | controller | Thursday 30 July 2026  16:46:23 +0000 (0:00:00.056)       0:00:04.090 *********
2026-07-30 16:46:23.061588 | controller | ===============================================================================
2026-07-30 16:46:23.061770 | controller | Gathering Facts --------------------------------------------------------- 1.23s
2026-07-30 16:46:23.061982 | controller | vexxhost.kubernetes.upload_helm_chart : Upload helm chart with multi_copy --- 1.13s
2026-07-30 16:46:23.062163 | controller | vexxhost.kubernetes.upload_helm_chart : Upload Helm chart --------------- 0.63s
2026-07-30 16:46:23.062365 | controller | vexxhost.kubernetes.upload_helm_chart : Ensure destination dir ---------- 0.43s
2026-07-30 16:46:23.062544 | controller | vexxhost.kubernetes.upload_helm_chart : Find destination files ---------- 0.42s
2026-07-30 16:46:23.062741 | controller | vexxhost.kubernetes.upload_helm_chart : Include help chart upload method tasks --- 0.09s
2026-07-30 16:46:23.062934 | controller | vexxhost.kubernetes.upload_helm_chart : Include help chart upload method tasks --- 0.06s
2026-07-30 16:46:23.063133 | controller | vexxhost.kubernetes.upload_helm_chart : Delete any destination files not in the sources --- 0.06s
2026-07-30 16:46:23.179684 | controller | INFO     [upload-helm-chart > converge] Executed: Successful
2026-07-30 16:46:23.190307 | controller | INFO     [upload-helm-chart > idempotence] Executing
2026-07-30 16:46:24.027694 | controller |
2026-07-30 16:46:24.027776 | controller | PLAY [Converge] ****************************************************************
2026-07-30 16:46:24.027937 | controller |
2026-07-30 16:46:24.028129 | controller | TASK [Gathering Facts] *********************************************************
2026-07-30 16:46:24.028324 | controller | Thursday 30 July 2026  16:46:24 +0000 (0:00:00.011)       0:00:00.011 *********
2026-07-30 16:46:26.100610 | 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-07-30 16:46:26.105410 | controller | ok: [controller]
2026-07-30 16:46:26.105602 | controller |
2026-07-30 16:46:26.105814 | controller | TASK [vexxhost.kubernetes.upload_helm_chart : Include help chart upload method tasks] ***
2026-07-30 16:46:26.106004 | controller | Thursday 30 July 2026  16:46:26 +0000 (0:00:02.077)       0:00:02.088 *********
2026-07-30 16:46:26.185312 | controller | included: /home/zuul/.ansible/collections/ansible_collections/vexxhost/kubernetes/roles/upload_helm_chart/tasks/synchronize.yml for controller
2026-07-30 16:46:26.185472 | controller |
2026-07-30 16:46:26.185675 | controller | TASK [vexxhost.kubernetes.upload_helm_chart : Upload Helm chart] ***************
2026-07-30 16:46:26.185867 | controller | Thursday 30 July 2026  16:46:26 +0000 (0:00:00.080)       0:00:02.168 *********
2026-07-30 16:46:26.873916 | controller | ok: [controller]
2026-07-30 16:46:26.874058 | controller |
2026-07-30 16:46:26.874320 | controller | TASK [vexxhost.kubernetes.upload_helm_chart : Include help chart upload method tasks] ***
2026-07-30 16:46:26.874546 | controller | Thursday 30 July 2026  16:46:26 +0000 (0:00:00.688)       0:00:02.857 *********
2026-07-30 16:46:26.916066 | controller | included: /home/zuul/.ansible/collections/ansible_collections/vexxhost/kubernetes/roles/upload_helm_chart/tasks/copy.yml for controller
2026-07-30 16:46:26.916225 | controller |
2026-07-30 16:46:26.916417 | controller | TASK [vexxhost.kubernetes.upload_helm_chart : Ensure destination dir] **********
2026-07-30 16:46:26.916658 | controller | Thursday 30 July 2026  16:46:26 +0000 (0:00:00.042)       0:00:02.899 *********
2026-07-30 16:46:27.347232 | controller | ok: [controller]
2026-07-30 16:46:27.347373 | controller |
2026-07-30 16:46:27.347590 | controller | TASK [vexxhost.kubernetes.upload_helm_chart : Upload helm chart with multi_copy] ***
2026-07-30 16:46:27.347790 | controller | Thursday 30 July 2026  16:46:27 +0000 (0:00:00.429)       0:00:03.329 *********
2026-07-30 16:46:29.450653 | controller | ok: [controller]
2026-07-30 16:46:29.450804 | controller |
2026-07-30 16:46:29.451093 | controller | TASK [vexxhost.kubernetes.upload_helm_chart : Find destination files] **********
2026-07-30 16:46:29.451310 | controller | Thursday 30 July 2026  16:46:29 +0000 (0:00:02.104)       0:00:05.433 *********
2026-07-30 16:46:29.856593 | controller | ok: [controller]
2026-07-30 16:46:29.856618 | controller |
2026-07-30 16:46:29.856625 | controller | TASK [vexxhost.kubernetes.upload_helm_chart : Delete any destination files not in the sources] ***
2026-07-30 16:46:29.856630 | controller | Thursday 30 July 2026  16:46:29 +0000 (0:00:00.404)       0:00:05.838 *********
2026-07-30 16:46:29.900900 | controller | skipping: [controller]
2026-07-30 16:46:29.901010 | controller |
2026-07-30 16:46:29.901138 | controller | PLAY RECAP *********************************************************************
2026-07-30 16:46:29.901293 | controller | controller                 : ok=7    changed=0    unreachable=0    failed=0    skipped=1    rescued=0    ignored=0
2026-07-30 16:46:29.901406 | controller |
2026-07-30 16:46:29.901508 | controller |
2026-07-30 16:46:29.901637 | controller | TASKS RECAP ********************************************************************
2026-07-30 16:46:29.901756 | controller | Thursday 30 July 2026  16:46:29 +0000 (0:00:00.044)       0:00:05.882 *********
2026-07-30 16:46:29.901873 | controller | ===============================================================================
2026-07-30 16:46:29.902005 | controller | vexxhost.kubernetes.upload_helm_chart : Upload helm chart with multi_copy --- 2.10s
2026-07-30 16:46:29.902127 | controller | Gathering Facts --------------------------------------------------------- 2.08s
2026-07-30 16:46:29.902254 | controller | vexxhost.kubernetes.upload_helm_chart : Upload Helm chart --------------- 0.69s
2026-07-30 16:46:29.902378 | controller | vexxhost.kubernetes.upload_helm_chart : Ensure destination dir ---------- 0.43s
2026-07-30 16:46:29.902502 | controller | vexxhost.kubernetes.upload_helm_chart : Find destination files ---------- 0.40s
2026-07-30 16:46:29.902632 | controller | vexxhost.kubernetes.upload_helm_chart : Include help chart upload method tasks --- 0.08s
2026-07-30 16:46:29.902762 | controller | vexxhost.kubernetes.upload_helm_chart : Delete any destination files not in the sources --- 0.04s
2026-07-30 16:46:29.902890 | controller | vexxhost.kubernetes.upload_helm_chart : Include help chart upload method tasks --- 0.04s
2026-07-30 16:46:29.995693 | controller | INFO     [upload-helm-chart > idempotence] Executed: Successful
2026-07-30 16:46:30.001766 | controller | INFO     [upload-helm-chart > side_effect] Executing
2026-07-30 16:46:30.828161 | controller |
2026-07-30 16:46:30.828384 | controller | PLAY [Side effect] *************************************************************
2026-07-30 16:46:30.828677 | controller |
2026-07-30 16:46:30.828816 | controller | TASK [Gathering Facts] *********************************************************
2026-07-30 16:46:30.829004 | controller | Thursday 30 July 2026  16:46:30 +0000 (0:00:00.011)       0:00:00.011 *********
2026-07-30 16:46:31.885331 | 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-07-30 16:46:31.893233 | controller | ok: [controller]
2026-07-30 16:46:31.893415 | controller |
2026-07-30 16:46:31.893631 | controller | TASK [vexxhost.kubernetes.upload_helm_chart : Include help chart upload method tasks] ***
2026-07-30 16:46:31.893827 | controller | Thursday 30 July 2026  16:46:31 +0000 (0:00:01.062)       0:00:01.073 *********
2026-07-30 16:46:31.966967 | controller | included: /home/zuul/.ansible/collections/ansible_collections/vexxhost/kubernetes/roles/upload_helm_chart/tasks/synchronize.yml for controller
2026-07-30 16:46:31.967147 | controller |
2026-07-30 16:46:31.967371 | controller | TASK [vexxhost.kubernetes.upload_helm_chart : Upload Helm chart] ***************
2026-07-30 16:46:31.967571 | controller | Thursday 30 July 2026  16:46:31 +0000 (0:00:00.076)       0:00:01.150 *********
2026-07-30 16:46:32.624599 | controller | changed: [controller]
2026-07-30 16:46:32.624781 | controller |
2026-07-30 16:46:32.625050 | controller | TASK [vexxhost.kubernetes.upload_helm_chart : Include help chart upload method tasks] ***
2026-07-30 16:46:32.625254 | controller | Thursday 30 July 2026  16:46:32 +0000 (0:00:00.657)       0:00:01.807 *********
2026-07-30 16:46:32.670058 | controller | included: /home/zuul/.ansible/collections/ansible_collections/vexxhost/kubernetes/roles/upload_helm_chart/tasks/copy.yml for controller
2026-07-30 16:46:32.670217 | controller |
2026-07-30 16:46:32.670422 | controller | TASK [vexxhost.kubernetes.upload_helm_chart : Ensure destination dir] **********
2026-07-30 16:46:32.670679 | controller | Thursday 30 July 2026  16:46:32 +0000 (0:00:00.046)       0:00:01.853 *********
2026-07-30 16:46:33.126362 | controller | ok: [controller]
2026-07-30 16:46:33.126403 | controller |
2026-07-30 16:46:33.126412 | controller | TASK [vexxhost.kubernetes.upload_helm_chart : Upload helm chart with multi_copy] ***
2026-07-30 16:46:33.126420 | controller | Thursday 30 July 2026  16:46:33 +0000 (0:00:00.455)       0:00:02.308 *********
2026-07-30 16:46:34.325123 | controller | ok: [controller]
2026-07-30 16:46:34.325197 | controller |
2026-07-30 16:46:34.325208 | controller | TASK [vexxhost.kubernetes.upload_helm_chart : Find destination files] **********
2026-07-30 16:46:34.325279 | controller | Thursday 30 July 2026  16:46:34 +0000 (0:00:01.196)       0:00:03.505 *********
2026-07-30 16:46:34.750614 | controller | ok: [controller]
2026-07-30 16:46:34.750680 | controller |
2026-07-30 16:46:34.750734 | controller | TASK [vexxhost.kubernetes.upload_helm_chart : Delete any destination files not in the sources] ***
2026-07-30 16:46:34.750835 | controller | Thursday 30 July 2026  16:46:34 +0000 (0:00:00.427)       0:00:03.932 *********
2026-07-30 16:46:35.076704 | controller | changed: [controller] => (item=/file)
2026-07-30 16:46:35.076773 | controller |
2026-07-30 16:46:35.076783 | controller | PLAY RECAP *********************************************************************
2026-07-30 16:46:35.076792 | controller | controller                 : ok=8    changed=2    unreachable=0    failed=0    skipped=0    rescued=0    ignored=0
2026-07-30 16:46:35.076800 | controller |
2026-07-30 16:46:35.076807 | controller |
2026-07-30 16:46:35.076814 | controller | TASKS RECAP ********************************************************************
2026-07-30 16:46:35.076844 | controller | Thursday 30 July 2026  16:46:35 +0000 (0:00:00.325)       0:00:04.258 *********
2026-07-30 16:46:35.076851 | controller | ===============================================================================
2026-07-30 16:46:35.076859 | controller | vexxhost.kubernetes.upload_helm_chart : Upload helm chart with multi_copy --- 1.20s
2026-07-30 16:46:35.076866 | controller | Gathering Facts --------------------------------------------------------- 1.06s
2026-07-30 16:46:35.076873 | controller | vexxhost.kubernetes.upload_helm_chart : Upload Helm chart --------------- 0.66s
2026-07-30 16:46:35.076880 | controller | vexxhost.kubernetes.upload_helm_chart : Ensure destination dir ---------- 0.46s
2026-07-30 16:46:35.076887 | controller | vexxhost.kubernetes.upload_helm_chart : Find destination files ---------- 0.43s
2026-07-30 16:46:35.076896 | controller | vexxhost.kubernetes.upload_helm_chart : Delete any destination files not in the sources --- 0.33s
2026-07-30 16:46:35.076903 | controller | vexxhost.kubernetes.upload_helm_chart : Include help chart upload method tasks --- 0.08s
2026-07-30 16:46:35.076910 | controller | vexxhost.kubernetes.upload_helm_chart : Include help chart upload method tasks --- 0.05s
2026-07-30 16:46:35.192673 | controller | INFO     [upload-helm-chart > side_effect] Executed: Successful
2026-07-30 16:46:35.203247 | controller | INFO     [upload-helm-chart > verify] Executing
2026-07-30 16:46:36.076606 | controller |
2026-07-30 16:46:36.076856 | controller | PLAY [Verify] ******************************************************************
2026-07-30 16:46:36.077064 | controller |
2026-07-30 16:46:36.077268 | controller | TASK [Gathering Facts] *********************************************************
2026-07-30 16:46:36.077479 | controller | Thursday 30 July 2026  16:46:36 +0000 (0:00:00.010)       0:00:00.010 *********
2026-07-30 16:46:37.157195 | 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-07-30 16:46:37.164157 | controller | ok: [controller]
2026-07-30 16:46:37.164270 | controller |
2026-07-30 16:46:37.164382 | controller | TASK [Stat file 1] *************************************************************
2026-07-30 16:46:37.164576 | controller | Thursday 30 July 2026  16:46:37 +0000 (0:00:01.087)       0:00:01.098 *********
2026-07-30 16:46:37.588276 | controller | ok: [controller]
2026-07-30 16:46:37.588451 | controller |
2026-07-30 16:46:37.588702 | controller | TASK [Stat file 2] *************************************************************
2026-07-30 16:46:37.588908 | controller | Thursday 30 July 2026  16:46:37 +0000 (0:00:00.423)       0:00:01.522 *********
2026-07-30 16:46:37.893590 | controller | ok: [controller]
2026-07-30 16:46:37.893756 | controller |
2026-07-30 16:46:37.893946 | controller | TASK [Stat removed file 1] *****************************************************
2026-07-30 16:46:37.894140 | controller | Thursday 30 July 2026  16:46:37 +0000 (0:00:00.305)       0:00:01.827 *********
2026-07-30 16:46:38.194787 | controller | ok: [controller]
2026-07-30 16:46:38.195109 | controller |
2026-07-30 16:46:38.195386 | controller | TASK [Stat removed file 2] *****************************************************
2026-07-30 16:46:38.195686 | controller | Thursday 30 July 2026  16:46:38 +0000 (0:00:00.301)       0:00:02.129 *********
2026-07-30 16:46:38.500159 | controller | ok: [controller]
2026-07-30 16:46:38.500245 | controller |
2026-07-30 16:46:38.500423 | controller | TASK [ansible.builtin.assert] **************************************************
2026-07-30 16:46:38.500628 | controller | Thursday 30 July 2026  16:46:38 +0000 (0:00:00.305)       0:00:02.434 *********
2026-07-30 16:46:38.536686 | controller | ok: [controller] => {
2026-07-30 16:46:38.536732 | controller |     "changed": false,
2026-07-30 16:46:38.536741 | controller |     "msg": "All assertions passed"
2026-07-30 16:46:38.536749 | controller | }
2026-07-30 16:46:38.536757 | controller |
2026-07-30 16:46:38.536765 | controller | PLAY RECAP *********************************************************************
2026-07-30 16:46:38.536774 | controller | controller                 : ok=6    changed=0    unreachable=0    failed=0    skipped=0    rescued=0    ignored=0
2026-07-30 16:46:38.536781 | controller |
2026-07-30 16:46:38.536803 | controller |
2026-07-30 16:46:38.536810 | controller | TASKS RECAP ********************************************************************
2026-07-30 16:46:38.536817 | controller | Thursday 30 July 2026  16:46:38 +0000 (0:00:00.032)       0:00:02.467 *********
2026-07-30 16:46:38.536824 | controller | ===============================================================================
2026-07-30 16:46:38.536831 | controller | Gathering Facts --------------------------------------------------------- 1.09s
2026-07-30 16:46:38.536838 | controller | Stat file 1 ------------------------------------------------------------- 0.42s
2026-07-30 16:46:38.536845 | controller | Stat removed file 2 ----------------------------------------------------- 0.31s
2026-07-30 16:46:38.536862 | controller | Stat file 2 ------------------------------------------------------------- 0.31s
2026-07-30 16:46:38.537348 | controller | Stat removed file 1 ----------------------------------------------------- 0.30s
2026-07-30 16:46:38.537379 | controller | ansible.builtin.assert -------------------------------------------------- 0.03s
2026-07-30 16:46:38.631731 | controller | INFO     [upload-helm-chart > verify] Executed: Successful
2026-07-30 16:46:38.638626 | controller | INFO     [upload-helm-chart > cleanup] Executing
2026-07-30 16:46:38.639019 | controller | WARNING  [upload-helm-chart > cleanup] Executed: Missing playbook (Remove from test_sequence to suppress)
2026-07-30 16:46:38.647029 | controller | INFO     [upload-helm-chart > destroy] Executing
2026-07-30 16:46:38.647149 | controller | WARNING  [upload-helm-chart > destroy] Skipping, '--destroy=never' requested.
2026-07-30 16:46:38.647241 | controller | INFO     [upload-helm-chart > destroy] Executed: Successful
2026-07-30 16:46:38.647536 | controller | WARNING  Molecule executed 1 scenario (1 missing files)
2026-07-30 16:46:39.210661 | controller | ok: Runtime: 0:01:08.241581
2026-07-30 16:46:39.215553 | 
2026-07-30 16:46:39.215765 | PLAY RECAP
2026-07-30 16:46:39.215823 | controller | ok: 4 changed: 3 unreachable: 0 failed: 0 skipped: 0 rescued: 0 ignored: 0
2026-07-30 16:46:39.215849 | 
2026-07-30 16:46:39.426769 | RUN END RESULT_NORMAL: [untrusted : github.com/vexxhost/zuul-jobs/playbooks/molecule/run.yaml@main]
2026-07-30 16:46:39.428459 | POST-RUN START: [untrusted : github.com/vexxhost/ansible-collection-kubernetes/test-playbooks/molecule/post.yml@main]
2026-07-30 16:46:40.053846 | 
2026-07-30 16:46:40.054001 | PLAY [all]
2026-07-30 16:46:40.065923 | 
2026-07-30 16:46:40.066003 | TASK [describe-kubernetes-objects : creating directory for cluster scoped objects]
2026-07-30 16:46:40.485581 | controller | changed
2026-07-30 16:46:40.491538 | 
2026-07-30 16:46:40.491633 | TASK [describe-kubernetes-objects : Gathering descriptions for cluster scoped objects]
2026-07-30 16:46:40.893364 | controller | xargs: warning: options --max-args and --replace/-I/-i are mutually exclusive, ignoring previous --max-args value
2026-07-30 16:46:40.893492 | controller | xargs: warning: options --max-args and --replace/-I/-i are mutually exclusive, ignoring previous --max-args value
2026-07-30 16:46:40.900783 | controller | environment: line 1: kubectl: command not found
2026-07-30 16:46:40.902962 | controller | xargs: warning: options --max-lines and --replace/-I/-i are mutually exclusive, ignoring previous --max-lines value
2026-07-30 16:46:40.903198 | controller | environment: line 1: kubectl: command not found
2026-07-30 16:46:40.904941 | controller | xargs: warning: options --max-lines and --replace/-I/-i are mutually exclusive, ignoring previous --max-lines value
2026-07-30 16:46:40.908570 | controller | environment: line 1: kubectl: command not found
2026-07-30 16:46:40.908907 | controller | environment: line 1: kubectl: command not found
2026-07-30 16:46:40.909888 | controller | xargs: warning: options --max-lines and --replace/-I/-i are mutually exclusive, ignoring previous --max-lines value
2026-07-30 16:46:40.911032 | controller | xargs: warning: options --max-lines and --replace/-I/-i are mutually exclusive, ignoring previous --max-lines value
2026-07-30 16:46:40.914214 | controller | environment: line 1: kubectl: command not found
2026-07-30 16:46:40.915348 | controller | xargs: warning: options --max-lines and --replace/-I/-i are mutually exclusive, ignoring previous --max-lines value
2026-07-30 16:46:41.023741 | controller | ok: Runtime: 0:00:00.036620
2026-07-30 16:46:41.029463 | 
2026-07-30 16:46:41.029558 | TASK [describe-kubernetes-objects : creating directory for namespace scoped objects]
2026-07-30 16:46:41.293587 | controller | changed
2026-07-30 16:46:41.297684 | 
2026-07-30 16:46:41.297764 | TASK [describe-kubernetes-objects : Gathering descriptions for namespace scoped objects]
2026-07-30 16:46:41.538309 | controller | environment: line 5: kubectl: command not found
2026-07-30 16:46:41.539233 | controller | xargs: warning: options --max-args and --replace/-I/-i are mutually exclusive, ignoring previous --max-args value
2026-07-30 16:46:41.539532 | controller | xargs: warning: options --max-args and --replace/-I/-i are mutually exclusive, ignoring previous --max-args value
2026-07-30 16:46:41.539989 | controller | xargs: warning: options --max-args and --replace/-I/-i are mutually exclusive, ignoring previous --max-args value
2026-07-30 16:46:41.828326 | controller | ok: Runtime: 0:00:00.014455
2026-07-30 16:46:41.835555 | 
2026-07-30 16:46:41.835625 | TASK [describe-kubernetes-objects : Downloads logs to executor]
2026-07-30 16:46:42.484233 | controller | changed:
2026-07-30 16:46:42.484526 | controller | created directory /var/lib/zuul/builds/ec967d1569294684b4853a2ce66e8bf9/work/logs/controller
2026-07-30 16:46:42.484592 | controller | cd+++++++++ objects/
2026-07-30 16:46:42.484643 | controller | cd+++++++++ objects/cluster/
2026-07-30 16:46:42.484693 | controller | cd+++++++++ objects/namespaced/
2026-07-30 16:46:42.492717 | 
2026-07-30 16:46:42.492787 | TASK [gather-pod-logs : creating directory for pod logs]
2026-07-30 16:46:42.730663 | controller | changed
2026-07-30 16:46:42.736288 | 
2026-07-30 16:46:42.736383 | TASK [gather-pod-logs : creating directory for failed pod logs]
2026-07-30 16:46:42.967741 | controller | changed
2026-07-30 16:46:42.973052 | 
2026-07-30 16:46:42.973145 | TASK [gather-pod-logs : retrieve all kubernetes logs, current and previous (if they exist)]
2026-07-30 16:46:43.230631 | controller | environment: line 3: kubectl: command not found
2026-07-30 16:46:43.505070 | controller | ok: Runtime: 0:00:00.014114
2026-07-30 16:46:43.511111 | 
2026-07-30 16:46:43.511189 | TASK [gather-pod-logs : Downloads pod logs to executor]
2026-07-30 16:46:43.991883 | controller | changed:
2026-07-30 16:46:43.992152 | controller | cd+++++++++ pod-logs/
2026-07-30 16:46:43.992215 | controller | cd+++++++++ pod-logs/failed-pods/
2026-07-30 16:46:43.999058 | 
2026-07-30 16:46:43.999121 | LOOP [helm-release-status : creating directory for helm release status]
2026-07-30 16:46:44.232506 | controller | changed: "values"
2026-07-30 16:46:44.460674 | controller | changed: "releases"
2026-07-30 16:46:44.473556 | 
2026-07-30 16:46:44.473732 | TASK [helm-release-status : Gather get release status for helm charts]
2026-07-30 16:46:44.713947 | controller | /bin/bash: line 3: kubectl: command not found
2026-07-30 16:46:45.004785 | controller | ok: Runtime: 0:00:00.009342
2026-07-30 16:46:45.011077 | 
2026-07-30 16:46:45.011142 | TASK [helm-release-status : Downloads logs to executor]
2026-07-30 16:46:45.520332 | controller | changed:
2026-07-30 16:46:45.520500 | controller | cd+++++++++ helm/
2026-07-30 16:46:45.520528 | controller | cd+++++++++ helm/releases/
2026-07-30 16:46:45.520551 | controller | cd+++++++++ helm/values/
2026-07-30 16:46:45.525272 | 
2026-07-30 16:46:45.525325 | PLAY RECAP
2026-07-30 16:46:45.525374 | controller | ok: 12 changed: 12 unreachable: 0 failed: 0 skipped: 0 rescued: 0 ignored: 0
2026-07-30 16:46:45.525396 | 
2026-07-30 16:46:45.644100 | POST-RUN END RESULT_NORMAL: [untrusted : github.com/vexxhost/ansible-collection-kubernetes/test-playbooks/molecule/post.yml@main]
2026-07-30 16:46:45.646107 | POST-RUN START: [trusted : github.com/vexxhost/zuul-config/playbooks/base/post.yaml@main]
2026-07-30 16:46:46.262939 | 
2026-07-30 16:46:46.263083 | PLAY [all]
2026-07-30 16:46:46.273716 | 
2026-07-30 16:46:46.273797 | TASK [fetch-output : Set log path for multiple nodes]
2026-07-30 16:46:46.319361 | controller | skipping: Conditional result was False
2026-07-30 16:46:46.327540 | 
2026-07-30 16:46:46.327679 | TASK [fetch-output : Set log path for single node]
2026-07-30 16:46:46.370019 | controller | ok
2026-07-30 16:46:46.376591 | 
2026-07-30 16:46:46.376806 | LOOP [fetch-output : Ensure local output dirs]
2026-07-30 16:46:46.783135 | controller -> localhost | ok: "/var/lib/zuul/builds/ec967d1569294684b4853a2ce66e8bf9/work/logs"
2026-07-30 16:46:47.007076 | controller -> localhost | changed: "/var/lib/zuul/builds/ec967d1569294684b4853a2ce66e8bf9/work/artifacts"
2026-07-30 16:46:47.213205 | controller -> localhost | changed: "/var/lib/zuul/builds/ec967d1569294684b4853a2ce66e8bf9/work/docs"
2026-07-30 16:46:47.230494 | 
2026-07-30 16:46:47.230849 | LOOP [fetch-output : Collect logs, artifacts and docs]
2026-07-30 16:46:47.930785 | controller | changed: .d..t...... ./
2026-07-30 16:46:47.930979 | controller | changed: All items complete
2026-07-30 16:46:47.931006 | 
2026-07-30 16:46:48.389935 | controller | changed: .d..t...... ./
2026-07-30 16:46:48.930464 | controller | changed: .d..t...... ./
2026-07-30 16:46:48.953506 | 
2026-07-30 16:46:48.953658 | LOOP [merge-output-to-logs : Move artifacts and docs to logs dir]
2026-07-30 16:46:49.400870 | controller -> localhost | ok: Item: artifacts Runtime: 0:00:00.006691
2026-07-30 16:46:49.623541 | controller -> localhost | ok: Item: docs Runtime: 0:00:00.007772
2026-07-30 16:46:49.643066 | 
2026-07-30 16:46:49.643218 | PLAY [all]
2026-07-30 16:46:49.648367 | 
2026-07-30 16:46:49.648439 | TASK [remove-build-sshkey : Remove the build SSH key from all nodes]
2026-07-30 16:46:50.099282 | controller | changed
2026-07-30 16:46:50.108203 | 
2026-07-30 16:46:50.108297 | PLAY RECAP
2026-07-30 16:46:50.108349 | controller | ok: 5 changed: 4 unreachable: 0 failed: 0 skipped: 1 rescued: 0 ignored: 0
2026-07-30 16:46:50.108371 | 
2026-07-30 16:46:50.296345 | POST-RUN END RESULT_NORMAL: [trusted : github.com/vexxhost/zuul-config/playbooks/base/post.yaml@main]
2026-07-30 16:46:50.299502 | POST-RUN START: [trusted : github.com/vexxhost/zuul-config/playbooks/base/post-logs.yaml@main]
2026-07-30 16:46:50.919222 | 
2026-07-30 16:46:50.919380 | PLAY [localhost]
2026-07-30 16:46:50.930457 | 
2026-07-30 16:46:50.930537 | TASK [Generate Zuul manifest]
2026-07-30 16:46:50.955001 | localhost | ok
2026-07-30 16:46:50.970118 | 
2026-07-30 16:46:50.970202 | TASK [generate-zuul-manifest : Generate Zuul manifest]
2026-07-30 16:46:51.348424 | localhost | changed
2026-07-30 16:46:51.361717 | 
2026-07-30 16:46:51.361895 | TASK [generate-zuul-manifest : Return Zuul manifest URL to Zuul]
2026-07-30 16:46:51.403154 | localhost | ok
2026-07-30 16:46:51.414280 | 
2026-07-30 16:46:51.414354 | TASK [Upload logs]
2026-07-30 16:46:51.436679 | localhost | ok
2026-07-30 16:46:51.506260 | 
2026-07-30 16:46:51.506442 | TASK [Set zuul-log-path fact]
2026-07-30 16:46:51.531027 | localhost | ok
2026-07-30 16:46:51.544135 | 
2026-07-30 16:46:51.544215 | TASK [set-zuul-log-path-fact : Set log path for a build]
2026-07-30 16:46:51.576796 | localhost | ok
2026-07-30 16:46:51.586916 | 
2026-07-30 16:46:51.586981 | TASK [upload-logs : Create log directories]
2026-07-30 16:46:52.038853 | localhost | changed
2026-07-30 16:46:52.044533 | 
2026-07-30 16:46:52.044611 | TASK [upload-logs : Ensure logs are readable before uploading]
2026-07-30 16:46:52.434125 | localhost -> localhost | ok: Runtime: 0:00:00.006096
2026-07-30 16:46:52.439098 | 
2026-07-30 16:46:52.439166 | TASK [upload-logs : Upload logs to log server]
2026-07-30 16:46:52.925399 | localhost | Output suppressed because no_log was given
2026-07-30 16:46:52.930560 | 
2026-07-30 16:46:52.930646 | LOOP [upload-logs : Compress console log and json output]
2026-07-30 16:46:52.975685 | localhost | skipping: Conditional result was False
2026-07-30 16:46:53.018292 | localhost | skipping: Conditional result was False
2026-07-30 16:46:53.034671 | 
2026-07-30 16:46:53.034825 | LOOP [upload-logs : Upload compressed console log and json output]
2026-07-30 16:46:53.081422 | localhost | skipping: Conditional result was False
2026-07-30 16:46:53.081862 | 
2026-07-30 16:46:53.085577 | localhost | skipping: Conditional result was False
2026-07-30 16:46:53.097080 | 
2026-07-30 16:46:53.097238 | LOOP [upload-logs : Upload console log and json output]