2026-04-28 01:04:08.264246 | Job console starting 2026-04-28 01:04:08.283535 | Updating git repos 2026-04-28 01:04:08.384078 | Cloning repos into workspace 2026-04-28 01:04:09.284723 | Restoring repo states 2026-04-28 01:04:09.311815 | Merging changes 2026-04-28 01:04:10.829083 | Checking out repos 2026-04-28 01:04:11.274798 | Preparing playbooks 2026-04-28 01:04:15.351249 | Running Ansible setup 2026-04-28 01:04:19.086578 | PRE-RUN START: [trusted : github.com/vexxhost/zuul-config/playbooks/base/pre.yaml@main] 2026-04-28 01:04:19.694459 | 2026-04-28 01:04:19.694588 | PLAY [localhost] 2026-04-28 01:04:19.721869 | 2026-04-28 01:04:19.722065 | TASK [Gathering Facts] 2026-04-28 01:04:20.833214 | localhost | ok 2026-04-28 01:04:20.841308 | 2026-04-28 01:04:20.841392 | TASK [Setup log path fact] 2026-04-28 01:04:20.870238 | localhost | ok 2026-04-28 01:04:20.883827 | 2026-04-28 01:04:20.883948 | TASK [set-zuul-log-path-fact : Set log path for a build] 2026-04-28 01:04:20.912696 | localhost | ok 2026-04-28 01:04:20.920127 | 2026-04-28 01:04:20.920200 | TASK [emit-job-header : Print job information] 2026-04-28 01:04:20.968751 | # Job Information 2026-04-28 01:04:20.968950 | Ansible Version: 2.16.16 2026-04-28 01:04:20.969002 | Job: ansible-collection-containers-molecule-forget-package-ubuntu-focal 2026-04-28 01:04:20.969026 | Pipeline: check 2026-04-28 01:04:20.969046 | Executor: 0a8996d2b663 2026-04-28 01:04:20.969066 | Triggered by: https://github.com/vexxhost/ansible-collection-containers/pull/125 2026-04-28 01:04:20.969088 | Event ID: 07f9bf70-429e-11f1-8b75-3e63c4c208bf 2026-04-28 01:04:20.971988 | 2026-04-28 01:04:20.972058 | LOOP [emit-job-header : Print node information] 2026-04-28 01:04:21.078523 | localhost | ok: 2026-04-28 01:04:21.079082 | localhost | # Node Information 2026-04-28 01:04:21.079128 | localhost | Inventory Hostname: ubuntu-focal 2026-04-28 01:04:21.079164 | localhost | Hostname: np0000170752 2026-04-28 01:04:21.079194 | localhost | Username: zuul 2026-04-28 01:04:21.079226 | localhost | Distro: Ubuntu 20.04 2026-04-28 01:04:21.079253 | localhost | Provider: yul1 2026-04-28 01:04:21.079282 | localhost | Region: ca-ymq-1 2026-04-28 01:04:21.079310 | localhost | Label: ubuntu-focal 2026-04-28 01:04:21.079336 | localhost | Product Name: OpenStack Nova 2026-04-28 01:04:21.079362 | localhost | Interface IP: 199.204.45.216 2026-04-28 01:04:21.094590 | 2026-04-28 01:04:21.094726 | TASK [log-inventory : Ensure Zuul Ansible directory exists] 2026-04-28 01:04:21.506785 | localhost -> localhost | changed 2026-04-28 01:04:21.512005 | 2026-04-28 01:04:21.512135 | TASK [log-inventory : Copy ansible inventory to logs dir] 2026-04-28 01:04:22.331002 | localhost -> localhost | changed 2026-04-28 01:04:22.338781 | 2026-04-28 01:04:22.338859 | PLAY [all] 2026-04-28 01:04:22.348987 | 2026-04-28 01:04:22.349055 | TASK [add-build-sshkey : Check to see if ssh key was already created for this build] 2026-04-28 01:04:22.583443 | ubuntu-focal -> localhost | ok 2026-04-28 01:04:22.589975 | 2026-04-28 01:04:22.590041 | TASK [add-build-sshkey : Create a new key in workspace based on build UUID] 2026-04-28 01:04:22.624598 | ubuntu-focal | ok 2026-04-28 01:04:22.639387 | ubuntu-focal | included: /var/lib/zuul/builds/21580e9a96464dc89a2269b4d7030fd7/trusted/project_1/opendev.org/zuul/zuul-jobs/roles/add-build-sshkey/tasks/create-key-and-replace.yaml 2026-04-28 01:04:22.644726 | 2026-04-28 01:04:22.644786 | TASK [add-build-sshkey : Create Temp SSH key] 2026-04-28 01:04:24.078958 | ubuntu-focal -> localhost | Generating public/private rsa key pair. 2026-04-28 01:04:24.079211 | ubuntu-focal -> localhost | Your identification has been saved in /var/lib/zuul/builds/21580e9a96464dc89a2269b4d7030fd7/work/21580e9a96464dc89a2269b4d7030fd7_id_rsa 2026-04-28 01:04:24.079244 | ubuntu-focal -> localhost | Your public key has been saved in /var/lib/zuul/builds/21580e9a96464dc89a2269b4d7030fd7/work/21580e9a96464dc89a2269b4d7030fd7_id_rsa.pub 2026-04-28 01:04:24.079267 | ubuntu-focal -> localhost | The key fingerprint is: 2026-04-28 01:04:24.079289 | ubuntu-focal -> localhost | SHA256:w1W5nS9mGp4j0kVLq/Y8ATz5CRbLhJ9xlpddDKo0JeU zuul-build-sshkey 2026-04-28 01:04:24.079324 | ubuntu-focal -> localhost | The key's randomart image is: 2026-04-28 01:04:24.079346 | ubuntu-focal -> localhost | +---[RSA 3072]----+ 2026-04-28 01:04:24.079369 | ubuntu-focal -> localhost | | ...+o.=o| 2026-04-28 01:04:24.079390 | ubuntu-focal -> localhost | | . +==.o o| 2026-04-28 01:04:24.079411 | ubuntu-focal -> localhost | | =+OE+ . | 2026-04-28 01:04:24.079431 | ubuntu-focal -> localhost | | . o%o+ o | 2026-04-28 01:04:24.079451 | ubuntu-focal -> localhost | | S..B + . | 2026-04-28 01:04:24.079471 | ubuntu-focal -> localhost | | . O + .| 2026-04-28 01:04:24.079491 | ubuntu-focal -> localhost | | . + B . | 2026-04-28 01:04:24.079511 | ubuntu-focal -> localhost | | . =.* | 2026-04-28 01:04:24.079533 | ubuntu-focal -> localhost | | o ooo | 2026-04-28 01:04:24.079553 | ubuntu-focal -> localhost | +----[SHA256]-----+ 2026-04-28 01:04:24.079605 | ubuntu-focal -> localhost | ok: Runtime: 0:00:01.035315 2026-04-28 01:04:24.084840 | 2026-04-28 01:04:24.084903 | TASK [add-build-sshkey : Remote setup ssh keys (linux)] 2026-04-28 01:04:24.107397 | ubuntu-focal | ok 2026-04-28 01:04:24.117583 | ubuntu-focal | included: /var/lib/zuul/builds/21580e9a96464dc89a2269b4d7030fd7/trusted/project_1/opendev.org/zuul/zuul-jobs/roles/add-build-sshkey/tasks/remote-linux.yaml 2026-04-28 01:04:24.124797 | 2026-04-28 01:04:24.124858 | TASK [add-build-sshkey : Remove previously added zuul-build-sshkey] 2026-04-28 01:04:24.149245 | ubuntu-focal | skipping: Conditional result was False 2026-04-28 01:04:24.155347 | 2026-04-28 01:04:24.155421 | TASK [add-build-sshkey : Enable access via build key on all nodes] 2026-04-28 01:04:24.585620 | ubuntu-focal | changed 2026-04-28 01:04:24.592288 | 2026-04-28 01:04:24.592353 | TASK [add-build-sshkey : Make sure user has a .ssh] 2026-04-28 01:04:24.765846 | ubuntu-focal | ok 2026-04-28 01:04:24.773020 | 2026-04-28 01:04:24.773089 | TASK [add-build-sshkey : Install build private key as SSH key on all nodes] 2026-04-28 01:04:25.208632 | ubuntu-focal | changed 2026-04-28 01:04:25.213938 | 2026-04-28 01:04:25.214007 | TASK [add-build-sshkey : Install build public key as SSH key on all nodes] 2026-04-28 01:04:25.661121 | ubuntu-focal | changed 2026-04-28 01:04:25.859369 | 2026-04-28 01:04:25.859545 | TASK [add-build-sshkey : Remote setup ssh keys (windows)] 2026-04-28 01:04:25.876888 | ubuntu-focal | skipping: Conditional result was False 2026-04-28 01:04:25.885162 | 2026-04-28 01:04:25.885314 | TASK [remove-zuul-sshkey : Remove master key from local agent] 2026-04-28 01:04:26.248549 | ubuntu-focal -> localhost | changed 2026-04-28 01:04:26.260197 | 2026-04-28 01:04:26.260286 | TASK [add-build-sshkey : Add back temp key] 2026-04-28 01:04:26.553867 | ubuntu-focal -> localhost | Identity added: /var/lib/zuul/builds/21580e9a96464dc89a2269b4d7030fd7/work/21580e9a96464dc89a2269b4d7030fd7_id_rsa (zuul-build-sshkey) 2026-04-28 01:04:26.554080 | ubuntu-focal -> localhost | ok: Runtime: 0:00:00.010203 2026-04-28 01:04:26.559040 | 2026-04-28 01:04:26.559107 | TASK [add-build-sshkey : Verify we can still SSH to all nodes] 2026-04-28 01:04:26.874640 | ubuntu-focal | ok 2026-04-28 01:04:26.881137 | 2026-04-28 01:04:26.881225 | TASK [add-build-sshkey : Verify we can still SSH to all nodes (windows)] 2026-04-28 01:04:26.907437 | ubuntu-focal | skipping: Conditional result was False 2026-04-28 01:04:26.922683 | 2026-04-28 01:04:26.922750 | TASK [prepare-workspace : Start zuul_console daemon.] 2026-04-28 01:04:27.232421 | ubuntu-focal | ok 2026-04-28 01:04:27.238183 | 2026-04-28 01:04:27.238251 | TASK [prepare-workspace : Synchronize src repos to workspace directory.] 2026-04-28 01:04:28.086868 | ubuntu-focal | Output suppressed because no_log was given 2026-04-28 01:04:28.097115 | 2026-04-28 01:04:28.097181 | LOOP [ensure-output-dirs : Empty Zuul Output directories by removing them] 2026-04-28 01:04:28.268594 | ubuntu-focal | ok: "logs" 2026-04-28 01:04:28.269322 | ubuntu-focal | ok: All items complete 2026-04-28 01:04:28.269371 | 2026-04-28 01:04:28.407374 | ubuntu-focal | ok: "artifacts" 2026-04-28 01:04:28.557390 | ubuntu-focal | ok: "docs" 2026-04-28 01:04:28.575227 | 2026-04-28 01:04:28.575419 | LOOP [ensure-output-dirs : Ensure Zuul Output directories exist] 2026-04-28 01:04:28.764937 | ubuntu-focal | changed: "logs" 2026-04-28 01:04:28.960044 | ubuntu-focal | changed: "artifacts" 2026-04-28 01:04:29.051952 | ubuntu-focal | changed: "docs" 2026-04-28 01:04:29.074036 | 2026-04-28 01:04:29.074198 | PLAY RECAP 2026-04-28 01:04:29.074250 | localhost | ok: 6 changed: 2 unreachable: 0 failed: 0 skipped: 0 rescued: 0 ignored: 0 2026-04-28 01:04:29.074282 | ubuntu-focal | ok: 15 changed: 8 unreachable: 0 failed: 0 skipped: 3 rescued: 0 ignored: 0 2026-04-28 01:04:29.074304 | 2026-04-28 01:04:29.266293 | PRE-RUN END RESULT_NORMAL: [trusted : github.com/vexxhost/zuul-config/playbooks/base/pre.yaml@main] 2026-04-28 01:04:29.268487 | PRE-RUN START: [untrusted : github.com/vexxhost/zuul-jobs/playbooks/molecule/pre.yaml@main] 2026-04-28 01:04:29.841412 | 2026-04-28 01:04:29.841539 | PLAY [all] 2026-04-28 01:04:29.852897 | 2026-04-28 01:04:29.852974 | TASK [setup-uv : Extract archive] 2026-04-28 01:04:31.991822 | ubuntu-focal | changed 2026-04-28 01:04:31.999472 | 2026-04-28 01:04:31.999567 | TASK [setup-uv : Print version] 2026-04-28 01:04:31.652567 | ubuntu-focal | uv 0.8.13 2026-04-28 01:04:32.537308 | ubuntu-focal | ok: Runtime: 0:00:00.010355 2026-04-28 01:04:32.543276 | 2026-04-28 01:04:32.543327 | PLAY RECAP 2026-04-28 01:04:32.543373 | ubuntu-focal | ok: 2 changed: 2 unreachable: 0 failed: 0 skipped: 0 rescued: 0 ignored: 0 2026-04-28 01:04:32.543399 | 2026-04-28 01:04:32.657853 | PRE-RUN END RESULT_NORMAL: [untrusted : github.com/vexxhost/zuul-jobs/playbooks/molecule/pre.yaml@main] 2026-04-28 01:04:32.659041 | RUN START: [untrusted : github.com/vexxhost/zuul-jobs/playbooks/molecule/run.yaml@main] 2026-04-28 01:04:33.264067 | 2026-04-28 01:04:33.264263 | PLAY [all] 2026-04-28 01:04:33.275001 | 2026-04-28 01:04:33.275072 | TASK [Copy inventory file for Zuul] 2026-04-28 01:04:34.164413 | ubuntu-focal | changed 2026-04-28 01:04:34.169469 | 2026-04-28 01:04:34.169548 | TASK [Switch "ansible_host" to private IP] 2026-04-28 01:04:34.431938 | ubuntu-focal | changed: 1 replacements made 2026-04-28 01:04:34.437859 | 2026-04-28 01:04:34.437927 | TASK [Run Molecule scenario] 2026-04-28 01:04:35.041450 | ubuntu-focal | Downloading cpython-3.13.7-linux-x86_64-gnu (download) (30.9MiB) 2026-04-28 01:04:35.776156 | ubuntu-focal | Downloading cpython-3.13.7-linux-x86_64-gnu (download) 2026-04-28 01:04:35.953011 | ubuntu-focal | Using CPython 3.13.7 2026-04-28 01:04:35.953080 | ubuntu-focal | Creating virtual environment at: .venv 2026-04-28 01:04:36.196354 | ubuntu-focal | Downloading cryptography (4.3MiB) 2026-04-28 01:04:36.203129 | ubuntu-focal | Downloading pygments (1.2MiB) 2026-04-28 01:04:36.203292 | ubuntu-focal | Downloading ansible-core (2.3MiB) 2026-04-28 01:04:36.352367 | ubuntu-focal | Downloading cryptography 2026-04-28 01:04:36.393511 | ubuntu-focal | Downloading pygments 2026-04-28 01:04:36.531340 | ubuntu-focal | Downloading ansible-core 2026-04-28 01:04:36.559699 | ubuntu-focal | Installed 36 packages in 28ms 2026-04-28 01:04:37.635893 | ubuntu-focal | INFO Collection 'vexxhost.containers' detected. 2026-04-28 01:04:37.635989 | ubuntu-focal | INFO Scenarios will be used from 'extensions/molecule' 2026-04-28 01:04:38.422922 | ubuntu-focal | CRITICAL 'extensions/molecule/default/molecule.yml' glob failed. Exiting. 2026-04-28 01:04:38.422998 | ubuntu-focal | INFO default scenario not found, disabling shared state. 2026-04-28 01:04:38.423020 | ubuntu-focal | INFO [forget-package > discovery] scenario test matrix: dependency, cleanup, destroy, syntax, create, prepare, converge, idempotence, side_effect, verify, cleanup, destroy 2026-04-28 01:04:38.423034 | ubuntu-focal | INFO [forget-package > prerun] Performing prerun with role_name_check=0... 2026-04-28 01:04:47.720854 | ubuntu-focal | INFO [forget-package > dependency] Executing 2026-04-28 01:04:47.721069 | ubuntu-focal | WARNING [forget-package > dependency] Missing roles requirements file: requirements.yml 2026-04-28 01:04:47.721368 | ubuntu-focal | WARNING [forget-package > dependency] Missing collections requirements file: collections.yml 2026-04-28 01:04:47.721515 | ubuntu-focal | WARNING [forget-package > dependency] Executed: 2 missing (Remove from test_sequence to suppress) 2026-04-28 01:04:47.728040 | ubuntu-focal | INFO [forget-package > cleanup] Executing 2026-04-28 01:04:47.728425 | ubuntu-focal | WARNING [forget-package > cleanup] Executed: Missing playbook (Remove from test_sequence to suppress) 2026-04-28 01:04:47.734826 | ubuntu-focal | INFO [forget-package > destroy] Executing 2026-04-28 01:04:47.734865 | ubuntu-focal | WARNING [forget-package > destroy] Skipping, '--destroy=never' requested. 2026-04-28 01:04:47.734952 | ubuntu-focal | INFO [forget-package > destroy] Executed: Successful 2026-04-28 01:04:47.741244 | ubuntu-focal | INFO [forget-package > syntax] Executing 2026-04-28 01:04:48.239543 | ubuntu-focal | [WARNING]: Deprecation warnings can be disabled by setting `deprecation_warnings=False` in ansible.cfg. 2026-04-28 01:04:48.239622 | ubuntu-focal | [DEPRECATION WARNING]: DEFAULT_MANAGED_STR option. Reason: The `ansible_managed` variable can be set just like any other variable, or a different variable can be used. 2026-04-28 01:04:48.239758 | ubuntu-focal | Alternatives: Set the `ansible_managed` variable, or use any custom variable in templates. This feature will be removed from ansible-core version 2.23. 2026-04-28 01:04:48.239857 | ubuntu-focal | 2026-04-28 01:04:48.583054 | ubuntu-focal | 2026-04-28 01:04:48.583260 | ubuntu-focal | playbook: /home/zuul/src/github.com/vexxhost/ansible-collection-containers/extensions/molecule/forget-package/converge.yml 2026-04-28 01:04:48.651421 | ubuntu-focal | INFO [forget-package > syntax] Executed: Successful 2026-04-28 01:04:48.662458 | ubuntu-focal | INFO [forget-package > create] Executing 2026-04-28 01:04:48.663842 | ubuntu-focal | WARNING [forget-package > create] Executed: Missing playbook (Remove from test_sequence to suppress) 2026-04-28 01:04:48.668834 | ubuntu-focal | INFO [forget-package > prepare] Executing 2026-04-28 01:04:49.140450 | ubuntu-focal | [WARNING]: Deprecation warnings can be disabled by setting `deprecation_warnings=False` in ansible.cfg. 2026-04-28 01:04:49.140521 | ubuntu-focal | [DEPRECATION WARNING]: DEFAULT_MANAGED_STR option. Reason: The `ansible_managed` variable can be set just like any other variable, or a different variable can be used. 2026-04-28 01:04:49.140653 | ubuntu-focal | Alternatives: Set the `ansible_managed` variable, or use any custom variable in templates. This feature will be removed from ansible-core version 2.23. 2026-04-28 01:04:49.140749 | ubuntu-focal | 2026-04-28 01:04:49.482576 | ubuntu-focal | 2026-04-28 01:04:49.482644 | ubuntu-focal | PLAY [Prepare] ***************************************************************** 2026-04-28 01:04:49.482713 | ubuntu-focal | 2026-04-28 01:04:49.482818 | ubuntu-focal | TASK [Gathering Facts] ********************************************************* 2026-04-28 01:04:49.482928 | ubuntu-focal | Tuesday 28 April 2026 01:04:49 +0000 (0:00:00.028) 0:00:00.028 ********* 2026-04-28 01:04:50.637748 | ubuntu-focal | [WARNING]: Host 'ubuntu-focal' is using the discovered Python interpreter at '/usr/bin/python3.8', but future installation of another Python interpreter could cause a different interpreter to be discovered. See https://docs.ansible.com/ansible-core/2.19/reference_appendices/interpreter_discovery.html for more information. 2026-04-28 01:04:50.640169 | ubuntu-focal | ok: [ubuntu-focal] 2026-04-28 01:04:50.640280 | ubuntu-focal | 2026-04-28 01:04:50.640411 | ubuntu-focal | TASK [Install NGINX] *********************************************************** 2026-04-28 01:04:50.640528 | ubuntu-focal | Tuesday 28 April 2026 01:04:50 +0000 (0:00:01.158) 0:00:01.187 ********* 2026-04-28 01:05:03.353933 | ubuntu-focal | changed: [ubuntu-focal] 2026-04-28 01:05:03.354066 | ubuntu-focal | 2026-04-28 01:05:03.354251 | ubuntu-focal | TASK [Ensure NGINX is running] ************************************************* 2026-04-28 01:05:03.354433 | ubuntu-focal | Tuesday 28 April 2026 01:05:03 +0000 (0:00:12.713) 0:00:13.900 ********* 2026-04-28 01:05:04.111549 | ubuntu-focal | ok: [ubuntu-focal] 2026-04-28 01:05:04.111694 | ubuntu-focal | 2026-04-28 01:05:04.111930 | ubuntu-focal | PLAY RECAP ********************************************************************* 2026-04-28 01:05:04.112134 | ubuntu-focal | ubuntu-focal : ok=3 changed=1 unreachable=0 failed=0 skipped=0 rescued=0 ignored=0 2026-04-28 01:05:04.112289 | ubuntu-focal | 2026-04-28 01:05:04.112467 | ubuntu-focal | 2026-04-28 01:05:04.112634 | ubuntu-focal | TASKS RECAP ******************************************************************** 2026-04-28 01:05:04.112816 | ubuntu-focal | Tuesday 28 April 2026 01:05:04 +0000 (0:00:00.758) 0:00:14.658 ********* 2026-04-28 01:05:04.113017 | ubuntu-focal | =============================================================================== 2026-04-28 01:05:04.113190 | ubuntu-focal | Install NGINX ---------------------------------------------------------- 12.71s 2026-04-28 01:05:04.113360 | ubuntu-focal | Gathering Facts --------------------------------------------------------- 1.16s 2026-04-28 01:05:04.113527 | ubuntu-focal | Ensure NGINX is running ------------------------------------------------- 0.76s 2026-04-28 01:05:04.248369 | ubuntu-focal | INFO [forget-package > prepare] Executed: Successful 2026-04-28 01:05:04.257854 | ubuntu-focal | INFO [forget-package > converge] Executing 2026-04-28 01:05:04.727050 | ubuntu-focal | [WARNING]: Deprecation warnings can be disabled by setting `deprecation_warnings=False` in ansible.cfg. 2026-04-28 01:05:04.727255 | ubuntu-focal | [DEPRECATION WARNING]: DEFAULT_MANAGED_STR option. Reason: The `ansible_managed` variable can be set just like any other variable, or a different variable can be used. 2026-04-28 01:05:04.727473 | ubuntu-focal | Alternatives: Set the `ansible_managed` variable, or use any custom variable in templates. This feature will be removed from ansible-core version 2.23. 2026-04-28 01:05:04.727638 | ubuntu-focal | 2026-04-28 01:05:05.018251 | ubuntu-focal | 2026-04-28 01:05:05.018403 | ubuntu-focal | PLAY [Converge] **************************************************************** 2026-04-28 01:05:05.018555 | ubuntu-focal | 2026-04-28 01:05:05.018733 | ubuntu-focal | TASK [Gathering Facts] ********************************************************* 2026-04-28 01:05:05.018908 | ubuntu-focal | Tuesday 28 April 2026 01:05:05 +0000 (0:00:00.007) 0:00:00.007 ********* 2026-04-28 01:05:06.019191 | ubuntu-focal | [WARNING]: Host 'ubuntu-focal' is using the discovered Python interpreter at '/usr/bin/python3.8', but future installation of another Python interpreter could cause a different interpreter to be discovered. See https://docs.ansible.com/ansible-core/2.19/reference_appendices/interpreter_discovery.html for more information. 2026-04-28 01:05:06.021197 | ubuntu-focal | ok: [ubuntu-focal] 2026-04-28 01:05:06.021353 | ubuntu-focal | 2026-04-28 01:05:06.021535 | ubuntu-focal | TASK [vexxhost.containers.forget_package : Forget package] ********************* 2026-04-28 01:05:06.021714 | ubuntu-focal | Tuesday 28 April 2026 01:05:06 +0000 (0:00:01.002) 0:00:01.010 ********* 2026-04-28 01:05:06.372604 | ubuntu-focal | [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-28 01:05:06.376016 | ubuntu-focal | changed: [ubuntu-focal] 2026-04-28 01:05:06.376203 | ubuntu-focal | 2026-04-28 01:05:06.376385 | ubuntu-focal | PLAY RECAP ********************************************************************* 2026-04-28 01:05:06.376574 | ubuntu-focal | ubuntu-focal : ok=2 changed=1 unreachable=0 failed=0 skipped=0 rescued=0 ignored=0 2026-04-28 01:05:06.376725 | ubuntu-focal | 2026-04-28 01:05:06.376883 | ubuntu-focal | 2026-04-28 01:05:06.377085 | ubuntu-focal | TASKS RECAP ******************************************************************** 2026-04-28 01:05:06.377254 | ubuntu-focal | Tuesday 28 April 2026 01:05:06 +0000 (0:00:00.355) 0:00:01.365 ********* 2026-04-28 01:05:06.377411 | ubuntu-focal | =============================================================================== 2026-04-28 01:05:06.377578 | ubuntu-focal | Gathering Facts --------------------------------------------------------- 1.00s 2026-04-28 01:05:06.377750 | ubuntu-focal | vexxhost.containers.forget_package : Forget package --------------------- 0.36s 2026-04-28 01:05:06.470768 | ubuntu-focal | INFO [forget-package > converge] Executed: Successful 2026-04-28 01:05:06.480120 | ubuntu-focal | INFO [forget-package > idempotence] Executing 2026-04-28 01:05:06.955379 | ubuntu-focal | [WARNING]: Deprecation warnings can be disabled by setting `deprecation_warnings=False` in ansible.cfg. 2026-04-28 01:05:06.955469 | ubuntu-focal | [DEPRECATION WARNING]: DEFAULT_MANAGED_STR option. Reason: The `ansible_managed` variable can be set just like any other variable, or a different variable can be used. 2026-04-28 01:05:06.955559 | ubuntu-focal | Alternatives: Set the `ansible_managed` variable, or use any custom variable in templates. This feature will be removed from ansible-core version 2.23. 2026-04-28 01:05:06.955633 | ubuntu-focal | 2026-04-28 01:05:07.260322 | ubuntu-focal | 2026-04-28 01:05:07.260375 | ubuntu-focal | PLAY [Converge] **************************************************************** 2026-04-28 01:05:07.260505 | ubuntu-focal | 2026-04-28 01:05:07.260602 | ubuntu-focal | TASK [Gathering Facts] ********************************************************* 2026-04-28 01:05:07.260724 | ubuntu-focal | Tuesday 28 April 2026 01:05:07 +0000 (0:00:00.007) 0:00:00.007 ********* 2026-04-28 01:05:08.256934 | ubuntu-focal | [WARNING]: Host 'ubuntu-focal' is using the discovered Python interpreter at '/usr/bin/python3.8', but future installation of another Python interpreter could cause a different interpreter to be discovered. See https://docs.ansible.com/ansible-core/2.19/reference_appendices/interpreter_discovery.html for more information. 2026-04-28 01:05:08.258566 | ubuntu-focal | ok: [ubuntu-focal] 2026-04-28 01:05:08.258638 | ubuntu-focal | 2026-04-28 01:05:08.258728 | ubuntu-focal | TASK [vexxhost.containers.forget_package : Forget package] ********************* 2026-04-28 01:05:08.258812 | ubuntu-focal | Tuesday 28 April 2026 01:05:08 +0000 (0:00:00.998) 0:00:01.006 ********* 2026-04-28 01:05:08.597240 | ubuntu-focal | ok: [ubuntu-focal] 2026-04-28 01:05:08.597392 | ubuntu-focal | 2026-04-28 01:05:08.597575 | ubuntu-focal | PLAY RECAP ********************************************************************* 2026-04-28 01:05:08.597781 | ubuntu-focal | ubuntu-focal : ok=2 changed=0 unreachable=0 failed=0 skipped=0 rescued=0 ignored=0 2026-04-28 01:05:08.597939 | ubuntu-focal | 2026-04-28 01:05:08.598093 | ubuntu-focal | 2026-04-28 01:05:08.598262 | ubuntu-focal | TASKS RECAP ******************************************************************** 2026-04-28 01:05:08.598444 | ubuntu-focal | Tuesday 28 April 2026 01:05:08 +0000 (0:00:00.338) 0:00:01.344 ********* 2026-04-28 01:05:08.598609 | ubuntu-focal | =============================================================================== 2026-04-28 01:05:08.598779 | ubuntu-focal | Gathering Facts --------------------------------------------------------- 1.00s 2026-04-28 01:05:08.598958 | ubuntu-focal | vexxhost.containers.forget_package : Forget package --------------------- 0.34s 2026-04-28 01:05:08.687412 | ubuntu-focal | INFO [forget-package > idempotence] Executed: Successful 2026-04-28 01:05:08.698911 | ubuntu-focal | INFO [forget-package > side_effect] Executing 2026-04-28 01:05:08.699199 | ubuntu-focal | WARNING [forget-package > side_effect] Executed: Missing playbook (Remove from test_sequence to suppress) 2026-04-28 01:05:08.704131 | ubuntu-focal | INFO [forget-package > verify] Executing 2026-04-28 01:05:09.179172 | ubuntu-focal | [WARNING]: Deprecation warnings can be disabled by setting `deprecation_warnings=False` in ansible.cfg. 2026-04-28 01:05:09.179375 | ubuntu-focal | [DEPRECATION WARNING]: DEFAULT_MANAGED_STR option. Reason: The `ansible_managed` variable can be set just like any other variable, or a different variable can be used. 2026-04-28 01:05:09.179592 | ubuntu-focal | Alternatives: Set the `ansible_managed` variable, or use any custom variable in templates. This feature will be removed from ansible-core version 2.23. 2026-04-28 01:05:09.179763 | ubuntu-focal | 2026-04-28 01:05:09.475425 | ubuntu-focal | 2026-04-28 01:05:09.475587 | ubuntu-focal | PLAY [Verify] ****************************************************************** 2026-04-28 01:05:09.475797 | ubuntu-focal | 2026-04-28 01:05:09.476083 | ubuntu-focal | TASK [Gathering Facts] ********************************************************* 2026-04-28 01:05:09.476294 | ubuntu-focal | Tuesday 28 April 2026 01:05:09 +0000 (0:00:00.007) 0:00:00.007 ********* 2026-04-28 01:05:10.537022 | ubuntu-focal | [WARNING]: Host 'ubuntu-focal' is using the discovered Python interpreter at '/usr/bin/python3.8', but future installation of another Python interpreter could cause a different interpreter to be discovered. See https://docs.ansible.com/ansible-core/2.19/reference_appendices/interpreter_discovery.html for more information. 2026-04-28 01:05:10.538784 | ubuntu-focal | ok: [ubuntu-focal] 2026-04-28 01:05:10.538959 | ubuntu-focal | 2026-04-28 01:05:10.539151 | ubuntu-focal | TASK [Populate package facts] ************************************************** 2026-04-28 01:05:10.539336 | ubuntu-focal | Tuesday 28 April 2026 01:05:10 +0000 (0:00:01.063) 0:00:01.071 ********* 2026-04-28 01:05:12.294398 | ubuntu-focal | ok: [ubuntu-focal] 2026-04-28 01:05:12.294521 | ubuntu-focal | 2026-04-28 01:05:12.294710 | ubuntu-focal | TASK [Populate service facts] ************************************************** 2026-04-28 01:05:12.294892 | ubuntu-focal | Tuesday 28 April 2026 01:05:12 +0000 (0:00:01.755) 0:00:02.826 ********* 2026-04-28 01:05:13.992468 | ubuntu-focal | ok: [ubuntu-focal] 2026-04-28 01:05:13.992551 | ubuntu-focal | 2026-04-28 01:05:13.992641 | ubuntu-focal | TASK [Assert that the NGINX package is not installed] ************************** 2026-04-28 01:05:13.992755 | ubuntu-focal | Tuesday 28 April 2026 01:05:13 +0000 (0:00:01.698) 0:00:04.524 ********* 2026-04-28 01:05:14.024756 | ubuntu-focal | ok: [ubuntu-focal] => { 2026-04-28 01:05:14.024950 | ubuntu-focal | "changed": false, 2026-04-28 01:05:14.025128 | ubuntu-focal | "msg": "All assertions passed" 2026-04-28 01:05:14.025295 | ubuntu-focal | } 2026-04-28 01:05:14.025447 | ubuntu-focal | 2026-04-28 01:05:14.025620 | ubuntu-focal | TASK [Assert that the NGINX service is still up] ******************************* 2026-04-28 01:05:14.025793 | ubuntu-focal | Tuesday 28 April 2026 01:05:14 +0000 (0:00:00.032) 0:00:04.556 ********* 2026-04-28 01:05:14.051593 | ubuntu-focal | ok: [ubuntu-focal] => { 2026-04-28 01:05:14.051766 | ubuntu-focal | "changed": false, 2026-04-28 01:05:14.051926 | ubuntu-focal | "msg": "All assertions passed" 2026-04-28 01:05:14.052087 | ubuntu-focal | } 2026-04-28 01:05:14.052247 | ubuntu-focal | 2026-04-28 01:05:14.052419 | ubuntu-focal | PLAY RECAP ********************************************************************* 2026-04-28 01:05:14.052596 | ubuntu-focal | ubuntu-focal : ok=5 changed=0 unreachable=0 failed=0 skipped=0 rescued=0 ignored=0 2026-04-28 01:05:14.052747 | ubuntu-focal | 2026-04-28 01:05:14.052943 | ubuntu-focal | 2026-04-28 01:05:14.053099 | ubuntu-focal | TASKS RECAP ******************************************************************** 2026-04-28 01:05:14.053270 | ubuntu-focal | Tuesday 28 April 2026 01:05:14 +0000 (0:00:00.027) 0:00:04.584 ********* 2026-04-28 01:05:14.053428 | ubuntu-focal | =============================================================================== 2026-04-28 01:05:14.053600 | ubuntu-focal | Populate package facts -------------------------------------------------- 1.76s 2026-04-28 01:05:14.053766 | ubuntu-focal | Populate service facts -------------------------------------------------- 1.70s 2026-04-28 01:05:14.053972 | ubuntu-focal | Gathering Facts --------------------------------------------------------- 1.06s 2026-04-28 01:05:14.054146 | ubuntu-focal | Assert that the NGINX package is not installed -------------------------- 0.03s 2026-04-28 01:05:14.054317 | ubuntu-focal | Assert that the NGINX service is still up ------------------------------- 0.03s 2026-04-28 01:05:14.175090 | ubuntu-focal | INFO [forget-package > verify] Executed: Successful 2026-04-28 01:05:14.187350 | ubuntu-focal | INFO [forget-package > cleanup] Executing 2026-04-28 01:05:14.187613 | ubuntu-focal | WARNING [forget-package > cleanup] Executed: Missing playbook (Remove from test_sequence to suppress) 2026-04-28 01:05:14.192500 | ubuntu-focal | INFO [forget-package > destroy] Executing 2026-04-28 01:05:14.192534 | ubuntu-focal | WARNING [forget-package > destroy] Skipping, '--destroy=never' requested. 2026-04-28 01:05:14.192601 | ubuntu-focal | INFO [forget-package > destroy] Executed: Successful 2026-04-28 01:05:14.192856 | ubuntu-focal | WARNING Molecule executed 1 scenario (1 missing files) 2026-04-28 01:05:14.534376 | ubuntu-focal | ok: Runtime: 0:00:39.507942 2026-04-28 01:05:14.537450 | 2026-04-28 01:05:14.537503 | PLAY RECAP 2026-04-28 01:05:14.537552 | ubuntu-focal | ok: 3 changed: 3 unreachable: 0 failed: 0 skipped: 0 rescued: 0 ignored: 0 2026-04-28 01:05:14.537574 | 2026-04-28 01:05:14.660697 | RUN END RESULT_NORMAL: [untrusted : github.com/vexxhost/zuul-jobs/playbooks/molecule/run.yaml@main] 2026-04-28 01:05:14.663212 | POST-RUN START: [trusted : github.com/vexxhost/zuul-config/playbooks/base/post.yaml@main] 2026-04-28 01:05:15.266694 | 2026-04-28 01:05:15.266855 | PLAY [all] 2026-04-28 01:05:15.278402 | 2026-04-28 01:05:15.278502 | TASK [fetch-output : Set log path for multiple nodes] 2026-04-28 01:05:15.324089 | ubuntu-focal | skipping: Conditional result was False 2026-04-28 01:05:15.330066 | 2026-04-28 01:05:15.330150 | TASK [fetch-output : Set log path for single node] 2026-04-28 01:05:15.374225 | ubuntu-focal | ok 2026-04-28 01:05:15.379717 | 2026-04-28 01:05:15.379783 | LOOP [fetch-output : Ensure local output dirs] 2026-04-28 01:05:15.756404 | ubuntu-focal -> localhost | ok: "/var/lib/zuul/builds/21580e9a96464dc89a2269b4d7030fd7/work/logs" 2026-04-28 01:05:15.987657 | ubuntu-focal -> localhost | changed: "/var/lib/zuul/builds/21580e9a96464dc89a2269b4d7030fd7/work/artifacts" 2026-04-28 01:05:16.291729 | ubuntu-focal -> localhost | changed: "/var/lib/zuul/builds/21580e9a96464dc89a2269b4d7030fd7/work/docs" 2026-04-28 01:05:16.304167 | 2026-04-28 01:05:16.304370 | LOOP [fetch-output : Collect logs, artifacts and docs] 2026-04-28 01:05:16.892655 | ubuntu-focal | changed: .d..t...... ./ 2026-04-28 01:05:16.893495 | ubuntu-focal | changed: All items complete 2026-04-28 01:05:16.893527 | 2026-04-28 01:05:17.393658 | ubuntu-focal | changed: .d..t...... ./ 2026-04-28 01:05:17.800291 | ubuntu-focal | changed: .d..t...... ./ 2026-04-28 01:05:17.822118 | 2026-04-28 01:05:17.822268 | LOOP [merge-output-to-logs : Move artifacts and docs to logs dir] 2026-04-28 01:05:18.384747 | ubuntu-focal -> localhost | ok: Item: artifacts Runtime: 0:00:00.007860 2026-04-28 01:05:18.672269 | ubuntu-focal -> localhost | ok: Item: docs Runtime: 0:00:00.006733 2026-04-28 01:05:18.687983 | 2026-04-28 01:05:18.688117 | PLAY [all] 2026-04-28 01:05:18.694261 | 2026-04-28 01:05:18.694333 | TASK [remove-build-sshkey : Remove the build SSH key from all nodes] 2026-04-28 01:05:19.141012 | ubuntu-focal | changed 2026-04-28 01:05:19.148285 | 2026-04-28 01:05:19.148368 | PLAY RECAP 2026-04-28 01:05:19.148437 | ubuntu-focal | ok: 5 changed: 4 unreachable: 0 failed: 0 skipped: 1 rescued: 0 ignored: 0 2026-04-28 01:05:19.148587 | 2026-04-28 01:05:19.302491 | POST-RUN END RESULT_NORMAL: [trusted : github.com/vexxhost/zuul-config/playbooks/base/post.yaml@main] 2026-04-28 01:05:19.303740 | POST-RUN START: [trusted : github.com/vexxhost/zuul-config/playbooks/base/post-logs.yaml@main] 2026-04-28 01:05:19.933622 | 2026-04-28 01:05:19.933770 | PLAY [localhost] 2026-04-28 01:05:19.944154 | 2026-04-28 01:05:19.944235 | TASK [Generate Zuul manifest] 2026-04-28 01:05:19.962391 | localhost | ok 2026-04-28 01:05:19.982399 | 2026-04-28 01:05:19.982573 | TASK [generate-zuul-manifest : Generate Zuul manifest] 2026-04-28 01:05:20.375092 | localhost | changed 2026-04-28 01:05:20.389420 | 2026-04-28 01:05:20.389529 | TASK [generate-zuul-manifest : Return Zuul manifest URL to Zuul] 2026-04-28 01:05:20.666557 | localhost | ok 2026-04-28 01:05:20.673849 | 2026-04-28 01:05:20.673933 | TASK [Upload logs] 2026-04-28 01:05:20.707464 | localhost | ok 2026-04-28 01:05:20.765074 | 2026-04-28 01:05:20.765229 | TASK [Set zuul-log-path fact] 2026-04-28 01:05:20.787752 | localhost | ok 2026-04-28 01:05:20.798826 | 2026-04-28 01:05:20.798897 | TASK [set-zuul-log-path-fact : Set log path for a build] 2026-04-28 01:05:20.829243 | localhost | ok 2026-04-28 01:05:20.837330 | 2026-04-28 01:05:20.837402 | TASK [upload-logs : Create log directories] 2026-04-28 01:05:21.228288 | localhost | changed 2026-04-28 01:05:21.233120 | 2026-04-28 01:05:21.233193 | TASK [upload-logs : Ensure logs are readable before uploading] 2026-04-28 01:05:21.730512 | localhost -> localhost | ok: Runtime: 0:00:00.008399 2026-04-28 01:05:21.738334 | 2026-04-28 01:05:21.738446 | TASK [upload-logs : Upload logs to log server] 2026-04-28 01:05:22.335254 | localhost | Output suppressed because no_log was given 2026-04-28 01:05:22.338940 | 2026-04-28 01:05:22.339008 | LOOP [upload-logs : Compress console log and json output] 2026-04-28 01:05:22.385423 | localhost | skipping: Conditional result was False 2026-04-28 01:05:22.392826 | localhost | skipping: Conditional result was False 2026-04-28 01:05:22.404435 | 2026-04-28 01:05:22.425142 | LOOP [upload-logs : Upload compressed console log and json output] 2026-04-28 01:05:22.472378 | localhost | skipping: Conditional result was False 2026-04-28 01:05:22.504553 | 2026-04-28 01:05:22.505868 | localhost | skipping: Conditional result was False 2026-04-28 01:05:22.519658 | 2026-04-28 01:05:22.550666 | LOOP [upload-logs : Upload console log and json output]