2026-05-06 01:00:41.486531 | Job console starting 2026-05-06 01:00:41.502977 | Updating git repos 2026-05-06 01:00:41.572401 | Cloning repos into workspace 2026-05-06 01:00:41.632691 | Restoring repo states 2026-05-06 01:00:41.638691 | Merging changes 2026-05-06 01:00:42.142386 | Checking out repos 2026-05-06 01:00:42.173785 | Preparing playbooks 2026-05-06 01:00:45.723528 | Running Ansible setup 2026-05-06 01:00:49.949192 | PRE-RUN START: [trusted : github.com/vexxhost/zuul-config/playbooks/base/pre.yaml@main] 2026-05-06 01:00:50.611767 | 2026-05-06 01:00:50.612118 | PLAY [localhost] 2026-05-06 01:00:50.626652 | 2026-05-06 01:00:50.626786 | TASK [Gathering Facts] 2026-05-06 01:00:51.711917 | localhost | ok 2026-05-06 01:00:51.719198 | 2026-05-06 01:00:51.719296 | TASK [Setup log path fact] 2026-05-06 01:00:51.737185 | localhost | ok 2026-05-06 01:00:51.747760 | 2026-05-06 01:00:51.747893 | TASK [set-zuul-log-path-fact : Set log path for a build] 2026-05-06 01:00:51.778502 | localhost | ok 2026-05-06 01:00:51.787145 | 2026-05-06 01:00:51.787262 | TASK [emit-job-header : Print job information] 2026-05-06 01:00:51.827725 | # Job Information 2026-05-06 01:00:51.828131 | Ansible Version: 2.16.18 2026-05-06 01:00:51.828522 | Job: ansible-collection-containers-molecule-forget-package-ubuntu-focal 2026-05-06 01:00:51.828604 | Pipeline: check 2026-05-06 01:00:51.828658 | Executor: 2d72f0692154 2026-05-06 01:00:51.828706 | Triggered by: https://github.com/vexxhost/ansible-collection-containers/pull/128 2026-05-06 01:00:51.828758 | Event ID: db2c2f60-48e6-11f1-9c3b-ab1656042994 2026-05-06 01:00:51.834085 | 2026-05-06 01:00:51.834189 | LOOP [emit-job-header : Print node information] 2026-05-06 01:00:51.930193 | localhost | ok: 2026-05-06 01:00:51.930430 | localhost | # Node Information 2026-05-06 01:00:51.930474 | localhost | Inventory Hostname: ubuntu-focal 2026-05-06 01:00:51.930506 | localhost | Hostname: np0000172070 2026-05-06 01:00:51.930536 | localhost | Username: zuul 2026-05-06 01:00:51.930571 | localhost | Distro: Ubuntu 20.04 2026-05-06 01:00:51.930601 | localhost | Provider: yul1 2026-05-06 01:00:51.930629 | localhost | Region: ca-ymq-1 2026-05-06 01:00:51.930656 | localhost | Label: ubuntu-focal 2026-05-06 01:00:51.930683 | localhost | Product Name: OpenStack Nova 2026-05-06 01:00:51.930711 | localhost | Interface IP: 199.19.213.12 2026-05-06 01:00:51.938958 | 2026-05-06 01:00:51.939110 | TASK [log-inventory : Ensure Zuul Ansible directory exists] 2026-05-06 01:00:52.425148 | localhost -> localhost | changed 2026-05-06 01:00:52.433850 | 2026-05-06 01:00:52.433993 | TASK [log-inventory : Copy ansible inventory to logs dir] 2026-05-06 01:00:53.445396 | localhost -> localhost | changed 2026-05-06 01:00:53.451741 | 2026-05-06 01:00:53.451799 | PLAY [all] 2026-05-06 01:00:53.459651 | 2026-05-06 01:00:53.459718 | TASK [add-build-sshkey : Check to see if ssh key was already created for this build] 2026-05-06 01:00:53.705793 | ubuntu-focal -> localhost | ok 2026-05-06 01:00:53.712043 | 2026-05-06 01:00:53.712111 | TASK [add-build-sshkey : Create a new key in workspace based on build UUID] 2026-05-06 01:00:53.741426 | ubuntu-focal | ok 2026-05-06 01:00:53.754647 | ubuntu-focal | included: /var/lib/zuul/builds/431935a78a4747da91c6d444409993ba/trusted/project_1/opendev.org/zuul/zuul-jobs/roles/add-build-sshkey/tasks/create-key-and-replace.yaml 2026-05-06 01:00:53.760883 | 2026-05-06 01:00:53.760967 | TASK [add-build-sshkey : Create Temp SSH key] 2026-05-06 01:00:54.904011 | ubuntu-focal -> localhost | Generating public/private rsa key pair. 2026-05-06 01:00:54.904209 | ubuntu-focal -> localhost | Your identification has been saved in /var/lib/zuul/builds/431935a78a4747da91c6d444409993ba/work/431935a78a4747da91c6d444409993ba_id_rsa 2026-05-06 01:00:54.904245 | ubuntu-focal -> localhost | Your public key has been saved in /var/lib/zuul/builds/431935a78a4747da91c6d444409993ba/work/431935a78a4747da91c6d444409993ba_id_rsa.pub 2026-05-06 01:00:54.904271 | ubuntu-focal -> localhost | The key fingerprint is: 2026-05-06 01:00:54.904294 | ubuntu-focal -> localhost | SHA256:kvNh+DSUXWcCzoSnD/3BzP7Lk1PLEPkhMwSThYGGAvQ zuul-build-sshkey 2026-05-06 01:00:54.904336 | ubuntu-focal -> localhost | The key's randomart image is: 2026-05-06 01:00:54.904855 | ubuntu-focal -> localhost | +---[RSA 3072]----+ 2026-05-06 01:00:54.905117 | ubuntu-focal -> localhost | | .o. ..+=O.o | 2026-05-06 01:00:54.905157 | ubuntu-focal -> localhost | | .. ..O.+.= | 2026-05-06 01:00:54.905204 | ubuntu-focal -> localhost | | E. ++++. . | 2026-05-06 01:00:54.905236 | ubuntu-focal -> localhost | | +o . =* . | 2026-05-06 01:00:54.905259 | ubuntu-focal -> localhost | | = So o .* .| 2026-05-06 01:00:54.905281 | ubuntu-focal -> localhost | | B o. o. ..| 2026-05-06 01:00:54.905302 | ubuntu-focal -> localhost | | o .oo.| 2026-05-06 01:00:54.905323 | ubuntu-focal -> localhost | | .=o | 2026-05-06 01:00:54.905347 | ubuntu-focal -> localhost | | o+ | 2026-05-06 01:00:54.905380 | ubuntu-focal -> localhost | +----[SHA256]-----+ 2026-05-06 01:00:54.905457 | ubuntu-focal -> localhost | ok: Runtime: 0:00:00.546990 2026-05-06 01:00:54.912116 | 2026-05-06 01:00:54.912193 | TASK [add-build-sshkey : Remote setup ssh keys (linux)] 2026-05-06 01:00:54.946917 | ubuntu-focal | ok 2026-05-06 01:00:54.960398 | ubuntu-focal | included: /var/lib/zuul/builds/431935a78a4747da91c6d444409993ba/trusted/project_1/opendev.org/zuul/zuul-jobs/roles/add-build-sshkey/tasks/remote-linux.yaml 2026-05-06 01:00:54.968784 | 2026-05-06 01:00:54.968942 | TASK [add-build-sshkey : Remove previously added zuul-build-sshkey] 2026-05-06 01:00:54.993849 | ubuntu-focal | skipping: Conditional result was False 2026-05-06 01:00:55.003292 | 2026-05-06 01:00:55.003442 | TASK [add-build-sshkey : Enable access via build key on all nodes] 2026-05-06 01:00:55.443761 | ubuntu-focal | changed 2026-05-06 01:00:55.449060 | 2026-05-06 01:00:55.449134 | TASK [add-build-sshkey : Make sure user has a .ssh] 2026-05-06 01:00:55.625113 | ubuntu-focal | ok 2026-05-06 01:00:55.633218 | 2026-05-06 01:00:55.633359 | TASK [add-build-sshkey : Install build private key as SSH key on all nodes] 2026-05-06 01:00:56.058379 | ubuntu-focal | changed 2026-05-06 01:00:56.064879 | 2026-05-06 01:00:56.064994 | TASK [add-build-sshkey : Install build public key as SSH key on all nodes] 2026-05-06 01:00:56.499898 | ubuntu-focal | changed 2026-05-06 01:00:56.504950 | 2026-05-06 01:00:56.505032 | TASK [add-build-sshkey : Remote setup ssh keys (windows)] 2026-05-06 01:00:56.526323 | ubuntu-focal | skipping: Conditional result was False 2026-05-06 01:00:56.534569 | 2026-05-06 01:00:56.534696 | TASK [remove-zuul-sshkey : Remove master key from local agent] 2026-05-06 01:00:56.955155 | ubuntu-focal -> localhost | changed 2026-05-06 01:00:56.966066 | 2026-05-06 01:00:56.966159 | TASK [add-build-sshkey : Add back temp key] 2026-05-06 01:00:57.260154 | ubuntu-focal -> localhost | Identity added: /var/lib/zuul/builds/431935a78a4747da91c6d444409993ba/work/431935a78a4747da91c6d444409993ba_id_rsa (zuul-build-sshkey) 2026-05-06 01:00:57.260362 | ubuntu-focal -> localhost | ok: Runtime: 0:00:00.011782 2026-05-06 01:00:57.265141 | 2026-05-06 01:00:57.265204 | TASK [add-build-sshkey : Verify we can still SSH to all nodes] 2026-05-06 01:00:57.599504 | ubuntu-focal | ok 2026-05-06 01:00:57.604228 | 2026-05-06 01:00:57.604297 | TASK [add-build-sshkey : Verify we can still SSH to all nodes (windows)] 2026-05-06 01:00:57.628921 | ubuntu-focal | skipping: Conditional result was False 2026-05-06 01:00:57.703142 | 2026-05-06 01:00:57.716451 | TASK [prepare-workspace : Start zuul_console daemon.] 2026-05-06 01:00:58.082707 | ubuntu-focal | ok 2026-05-06 01:00:58.088710 | 2026-05-06 01:00:58.088805 | TASK [prepare-workspace : Synchronize src repos to workspace directory.] 2026-05-06 01:00:58.931453 | ubuntu-focal | Output suppressed because no_log was given 2026-05-06 01:00:58.944435 | 2026-05-06 01:00:58.944566 | LOOP [ensure-output-dirs : Empty Zuul Output directories by removing them] 2026-05-06 01:00:59.199407 | ubuntu-focal | ok: "logs" 2026-05-06 01:00:59.199694 | ubuntu-focal | ok: All items complete 2026-05-06 01:00:59.199737 | 2026-05-06 01:00:59.273010 | ubuntu-focal | ok: "artifacts" 2026-05-06 01:00:59.416770 | ubuntu-focal | ok: "docs" 2026-05-06 01:00:59.430169 | 2026-05-06 01:00:59.430328 | LOOP [ensure-output-dirs : Ensure Zuul Output directories exist] 2026-05-06 01:00:59.631671 | ubuntu-focal | changed: "logs" 2026-05-06 01:00:59.773662 | ubuntu-focal | changed: "artifacts" 2026-05-06 01:00:59.971075 | ubuntu-focal | changed: "docs" 2026-05-06 01:00:59.996351 | 2026-05-06 01:00:59.996523 | PLAY RECAP 2026-05-06 01:00:59.996602 | localhost | ok: 6 changed: 2 unreachable: 0 failed: 0 skipped: 0 rescued: 0 ignored: 0 2026-05-06 01:00:59.996660 | ubuntu-focal | ok: 15 changed: 8 unreachable: 0 failed: 0 skipped: 3 rescued: 0 ignored: 0 2026-05-06 01:00:59.996702 | 2026-05-06 01:01:00.237720 | PRE-RUN END RESULT_NORMAL: [trusted : github.com/vexxhost/zuul-config/playbooks/base/pre.yaml@main] 2026-05-06 01:01:00.239248 | PRE-RUN START: [untrusted : github.com/vexxhost/zuul-jobs/playbooks/molecule/pre.yaml@main] 2026-05-06 01:01:00.929178 | 2026-05-06 01:01:00.929369 | PLAY [all] 2026-05-06 01:01:00.946081 | 2026-05-06 01:01:00.946334 | TASK [setup-uv : Extract archive] 2026-05-06 01:01:03.238430 | ubuntu-focal | changed 2026-05-06 01:01:03.247135 | 2026-05-06 01:01:03.247269 | TASK [setup-uv : Print version] 2026-05-06 01:01:02.389237 | ubuntu-focal | uv 0.8.13 2026-05-06 01:01:03.789727 | ubuntu-focal | ok: Runtime: 0:00:00.010251 2026-05-06 01:01:03.798418 | 2026-05-06 01:01:03.798500 | PLAY RECAP 2026-05-06 01:01:03.798562 | ubuntu-focal | ok: 2 changed: 2 unreachable: 0 failed: 0 skipped: 0 rescued: 0 ignored: 0 2026-05-06 01:01:03.798596 | 2026-05-06 01:01:03.932261 | PRE-RUN END RESULT_NORMAL: [untrusted : github.com/vexxhost/zuul-jobs/playbooks/molecule/pre.yaml@main] 2026-05-06 01:01:03.934713 | RUN START: [untrusted : github.com/vexxhost/zuul-jobs/playbooks/molecule/run.yaml@main] 2026-05-06 01:01:04.593869 | 2026-05-06 01:01:04.594041 | PLAY [all] 2026-05-06 01:01:04.608696 | 2026-05-06 01:01:04.608881 | TASK [Copy inventory file for Zuul] 2026-05-06 01:01:05.484456 | ubuntu-focal | changed 2026-05-06 01:01:05.491953 | 2026-05-06 01:01:05.492073 | TASK [Switch "ansible_host" to private IP] 2026-05-06 01:01:05.822511 | ubuntu-focal | changed: 1 replacements made 2026-05-06 01:01:05.828342 | 2026-05-06 01:01:05.828440 | TASK [Run Molecule scenario] 2026-05-06 01:01:05.208178 | ubuntu-focal | Downloading cpython-3.13.7-linux-x86_64-gnu (download) (30.9MiB) 2026-05-06 01:01:05.886730 | ubuntu-focal | Downloading cpython-3.13.7-linux-x86_64-gnu (download) 2026-05-06 01:01:06.087363 | ubuntu-focal | Using CPython 3.13.7 2026-05-06 01:01:06.087468 | ubuntu-focal | Creating virtual environment at: .venv 2026-05-06 01:01:06.975023 | ubuntu-focal | Downloading cryptography (4.3MiB) 2026-05-06 01:01:06.975594 | ubuntu-focal | Downloading pygments (1.2MiB) 2026-05-06 01:01:06.977405 | ubuntu-focal | Downloading ansible-core (2.3MiB) 2026-05-06 01:01:07.272290 | ubuntu-focal | Downloading pygments 2026-05-06 01:01:07.306507 | ubuntu-focal | Downloading cryptography 2026-05-06 01:01:07.383338 | ubuntu-focal | Downloading ansible-core 2026-05-06 01:01:07.405213 | ubuntu-focal | Installed 36 packages in 21ms 2026-05-06 01:01:08.493872 | ubuntu-focal | INFO Collection 'vexxhost.containers' detected. 2026-05-06 01:01:08.493966 | ubuntu-focal | INFO Scenarios will be used from 'extensions/molecule' 2026-05-06 01:01:09.339139 | ubuntu-focal | CRITICAL 'extensions/molecule/default/molecule.yml' glob failed. Exiting. 2026-05-06 01:01:09.339240 | ubuntu-focal | INFO default scenario not found, disabling shared state. 2026-05-06 01:01:09.339264 | ubuntu-focal | INFO [forget-package > discovery] scenario test matrix: dependency, cleanup, destroy, syntax, create, prepare, converge, idempotence, side_effect, verify, cleanup, destroy 2026-05-06 01:01:09.339279 | ubuntu-focal | INFO [forget-package > prerun] Performing prerun with role_name_check=0... 2026-05-06 01:01:37.915550 | ubuntu-focal | INFO [forget-package > dependency] Executing 2026-05-06 01:01:37.915749 | ubuntu-focal | WARNING [forget-package > dependency] Missing roles requirements file: requirements.yml 2026-05-06 01:01:37.916057 | ubuntu-focal | WARNING [forget-package > dependency] Missing collections requirements file: collections.yml 2026-05-06 01:01:37.916160 | ubuntu-focal | WARNING [forget-package > dependency] Executed: 2 missing (Remove from test_sequence to suppress) 2026-05-06 01:01:37.922115 | ubuntu-focal | INFO [forget-package > cleanup] Executing 2026-05-06 01:01:37.922444 | ubuntu-focal | WARNING [forget-package > cleanup] Executed: Missing playbook (Remove from test_sequence to suppress) 2026-05-06 01:01:37.927601 | ubuntu-focal | INFO [forget-package > destroy] Executing 2026-05-06 01:01:37.927635 | ubuntu-focal | WARNING [forget-package > destroy] Skipping, '--destroy=never' requested. 2026-05-06 01:01:37.927702 | ubuntu-focal | INFO [forget-package > destroy] Executed: Successful 2026-05-06 01:01:37.932621 | ubuntu-focal | INFO [forget-package > syntax] Executing 2026-05-06 01:01:38.419776 | ubuntu-focal | [WARNING]: Deprecation warnings can be disabled by setting `deprecation_warnings=False` in ansible.cfg. 2026-05-06 01:01:38.419980 | 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-05-06 01:01:38.420118 | 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-05-06 01:01:38.420229 | ubuntu-focal | 2026-05-06 01:01:38.753727 | ubuntu-focal | 2026-05-06 01:01:38.753880 | ubuntu-focal | playbook: /home/zuul/src/github.com/vexxhost/ansible-collection-containers/extensions/molecule/forget-package/converge.yml 2026-05-06 01:01:38.810919 | ubuntu-focal | INFO [forget-package > syntax] Executed: Successful 2026-05-06 01:01:38.820770 | ubuntu-focal | INFO [forget-package > create] Executing 2026-05-06 01:01:38.822042 | ubuntu-focal | WARNING [forget-package > create] Executed: Missing playbook (Remove from test_sequence to suppress) 2026-05-06 01:01:38.827023 | ubuntu-focal | INFO [forget-package > prepare] Executing 2026-05-06 01:01:39.314526 | ubuntu-focal | [WARNING]: Deprecation warnings can be disabled by setting `deprecation_warnings=False` in ansible.cfg. 2026-05-06 01:01:39.314653 | 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-05-06 01:01:39.314913 | 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-05-06 01:01:39.315042 | ubuntu-focal | 2026-05-06 01:01:39.648804 | ubuntu-focal | 2026-05-06 01:01:39.649002 | ubuntu-focal | PLAY [Prepare] ***************************************************************** 2026-05-06 01:01:39.649202 | ubuntu-focal | 2026-05-06 01:01:39.649461 | ubuntu-focal | TASK [Gathering Facts] ********************************************************* 2026-05-06 01:01:39.649677 | ubuntu-focal | Wednesday 06 May 2026 01:01:39 +0000 (0:00:00.028) 0:00:00.028 ********* 2026-05-06 01:01:40.810634 | 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-05-06 01:01:40.813036 | ubuntu-focal | ok: [ubuntu-focal] 2026-05-06 01:01:40.813290 | ubuntu-focal | 2026-05-06 01:01:40.813601 | ubuntu-focal | TASK [Install NGINX] *********************************************************** 2026-05-06 01:01:40.813888 | ubuntu-focal | Wednesday 06 May 2026 01:01:40 +0000 (0:00:01.164) 0:00:01.193 ********* 2026-05-06 01:02:07.542991 | ubuntu-focal | changed: [ubuntu-focal] 2026-05-06 01:02:07.543144 | ubuntu-focal | 2026-05-06 01:02:07.543351 | ubuntu-focal | TASK [Ensure NGINX is running] ************************************************* 2026-05-06 01:02:07.543570 | ubuntu-focal | Wednesday 06 May 2026 01:02:07 +0000 (0:00:26.729) 0:00:27.923 ********* 2026-05-06 01:02:08.166626 | ubuntu-focal | ok: [ubuntu-focal] 2026-05-06 01:02:08.166753 | ubuntu-focal | 2026-05-06 01:02:08.166964 | ubuntu-focal | PLAY RECAP ********************************************************************* 2026-05-06 01:02:08.167181 | ubuntu-focal | ubuntu-focal : ok=3 changed=1 unreachable=0 failed=0 skipped=0 rescued=0 ignored=0 2026-05-06 01:02:08.167346 | ubuntu-focal | 2026-05-06 01:02:08.167578 | ubuntu-focal | 2026-05-06 01:02:08.167722 | ubuntu-focal | TASKS RECAP ******************************************************************** 2026-05-06 01:02:08.167912 | ubuntu-focal | Wednesday 06 May 2026 01:02:08 +0000 (0:00:00.623) 0:00:28.547 ********* 2026-05-06 01:02:08.168076 | ubuntu-focal | =============================================================================== 2026-05-06 01:02:08.168254 | ubuntu-focal | Install NGINX ---------------------------------------------------------- 26.73s 2026-05-06 01:02:08.168501 | ubuntu-focal | Gathering Facts --------------------------------------------------------- 1.16s 2026-05-06 01:02:08.168737 | ubuntu-focal | Ensure NGINX is running ------------------------------------------------- 0.62s 2026-05-06 01:02:08.253582 | ubuntu-focal | INFO [forget-package > prepare] Executed: Successful 2026-05-06 01:02:08.263091 | ubuntu-focal | INFO [forget-package > converge] Executing 2026-05-06 01:02:08.719441 | ubuntu-focal | [WARNING]: Deprecation warnings can be disabled by setting `deprecation_warnings=False` in ansible.cfg. 2026-05-06 01:02:08.719707 | 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-05-06 01:02:08.719973 | 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-05-06 01:02:08.720211 | ubuntu-focal | 2026-05-06 01:02:09.025650 | ubuntu-focal | 2026-05-06 01:02:09.025782 | ubuntu-focal | PLAY [Converge] **************************************************************** 2026-05-06 01:02:09.025942 | ubuntu-focal | 2026-05-06 01:02:09.026123 | ubuntu-focal | TASK [Gathering Facts] ********************************************************* 2026-05-06 01:02:09.026293 | ubuntu-focal | Wednesday 06 May 2026 01:02:09 +0000 (0:00:00.007) 0:00:00.007 ********* 2026-05-06 01:02:10.049426 | 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-05-06 01:02:10.052696 | ubuntu-focal | ok: [ubuntu-focal] 2026-05-06 01:02:10.052907 | ubuntu-focal | 2026-05-06 01:02:10.053149 | ubuntu-focal | TASK [vexxhost.containers.forget_package : Forget package] ********************* 2026-05-06 01:02:10.053375 | ubuntu-focal | Wednesday 06 May 2026 01:02:10 +0000 (0:00:01.026) 0:00:01.034 ********* 2026-05-06 01:02:10.410930 | 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-05-06 01:02:10.415805 | ubuntu-focal | changed: [ubuntu-focal] 2026-05-06 01:02:10.416030 | ubuntu-focal | 2026-05-06 01:02:10.416281 | ubuntu-focal | PLAY RECAP ********************************************************************* 2026-05-06 01:02:10.416536 | ubuntu-focal | ubuntu-focal : ok=2 changed=1 unreachable=0 failed=0 skipped=0 rescued=0 ignored=0 2026-05-06 01:02:10.416746 | ubuntu-focal | 2026-05-06 01:02:10.416949 | ubuntu-focal | 2026-05-06 01:02:10.417199 | ubuntu-focal | TASKS RECAP ******************************************************************** 2026-05-06 01:02:10.417424 | ubuntu-focal | Wednesday 06 May 2026 01:02:10 +0000 (0:00:00.363) 0:00:01.398 ********* 2026-05-06 01:02:10.417642 | ubuntu-focal | =============================================================================== 2026-05-06 01:02:10.417874 | ubuntu-focal | Gathering Facts --------------------------------------------------------- 1.03s 2026-05-06 01:02:10.418103 | ubuntu-focal | vexxhost.containers.forget_package : Forget package --------------------- 0.36s 2026-05-06 01:02:10.544682 | ubuntu-focal | INFO [forget-package > converge] Executed: Successful 2026-05-06 01:02:10.554671 | ubuntu-focal | INFO [forget-package > idempotence] Executing 2026-05-06 01:02:11.051185 | ubuntu-focal | [WARNING]: Deprecation warnings can be disabled by setting `deprecation_warnings=False` in ansible.cfg. 2026-05-06 01:02:11.051503 | 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-05-06 01:02:11.051780 | 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-05-06 01:02:11.051978 | ubuntu-focal | 2026-05-06 01:02:11.350449 | ubuntu-focal | 2026-05-06 01:02:11.350608 | ubuntu-focal | PLAY [Converge] **************************************************************** 2026-05-06 01:02:11.350782 | ubuntu-focal | 2026-05-06 01:02:11.350975 | ubuntu-focal | TASK [Gathering Facts] ********************************************************* 2026-05-06 01:02:11.351166 | ubuntu-focal | Wednesday 06 May 2026 01:02:11 +0000 (0:00:00.007) 0:00:00.007 ********* 2026-05-06 01:02:12.425294 | 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-05-06 01:02:12.426266 | ubuntu-focal | ok: [ubuntu-focal] 2026-05-06 01:02:12.426452 | ubuntu-focal | 2026-05-06 01:02:12.426655 | ubuntu-focal | TASK [vexxhost.containers.forget_package : Forget package] ********************* 2026-05-06 01:02:12.426950 | ubuntu-focal | Wednesday 06 May 2026 01:02:12 +0000 (0:00:01.076) 0:00:01.084 ********* 2026-05-06 01:02:12.768929 | ubuntu-focal | ok: [ubuntu-focal] 2026-05-06 01:02:12.769091 | ubuntu-focal | 2026-05-06 01:02:12.769372 | ubuntu-focal | PLAY RECAP ********************************************************************* 2026-05-06 01:02:12.769580 | ubuntu-focal | ubuntu-focal : ok=2 changed=0 unreachable=0 failed=0 skipped=0 rescued=0 ignored=0 2026-05-06 01:02:12.769756 | ubuntu-focal | 2026-05-06 01:02:12.769924 | ubuntu-focal | 2026-05-06 01:02:12.770119 | ubuntu-focal | TASKS RECAP ******************************************************************** 2026-05-06 01:02:12.770326 | ubuntu-focal | Wednesday 06 May 2026 01:02:12 +0000 (0:00:00.342) 0:00:01.426 ********* 2026-05-06 01:02:12.770481 | ubuntu-focal | =============================================================================== 2026-05-06 01:02:12.770656 | ubuntu-focal | Gathering Facts --------------------------------------------------------- 1.08s 2026-05-06 01:02:12.770838 | ubuntu-focal | vexxhost.containers.forget_package : Forget package --------------------- 0.34s 2026-05-06 01:02:12.858605 | ubuntu-focal | INFO [forget-package > idempotence] Executed: Successful 2026-05-06 01:02:12.866319 | ubuntu-focal | INFO [forget-package > side_effect] Executing 2026-05-06 01:02:12.866714 | ubuntu-focal | WARNING [forget-package > side_effect] Executed: Missing playbook (Remove from test_sequence to suppress) 2026-05-06 01:02:12.872739 | ubuntu-focal | INFO [forget-package > verify] Executing 2026-05-06 01:02:13.371902 | ubuntu-focal | [WARNING]: Deprecation warnings can be disabled by setting `deprecation_warnings=False` in ansible.cfg. 2026-05-06 01:02:13.372073 | 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-05-06 01:02:13.372288 | 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-05-06 01:02:13.372500 | ubuntu-focal | 2026-05-06 01:02:13.678058 | ubuntu-focal | 2026-05-06 01:02:13.678126 | ubuntu-focal | PLAY [Verify] ****************************************************************** 2026-05-06 01:02:13.678252 | ubuntu-focal | 2026-05-06 01:02:13.678378 | ubuntu-focal | TASK [Gathering Facts] ********************************************************* 2026-05-06 01:02:13.678508 | ubuntu-focal | Wednesday 06 May 2026 01:02:13 +0000 (0:00:00.007) 0:00:00.007 ********* 2026-05-06 01:02:14.670396 | 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-05-06 01:02:14.673477 | ubuntu-focal | ok: [ubuntu-focal] 2026-05-06 01:02:14.673617 | ubuntu-focal | 2026-05-06 01:02:14.673819 | ubuntu-focal | TASK [Populate package facts] ************************************************** 2026-05-06 01:02:14.674016 | ubuntu-focal | Wednesday 06 May 2026 01:02:14 +0000 (0:00:00.995) 0:00:01.002 ********* 2026-05-06 01:02:16.410593 | ubuntu-focal | ok: [ubuntu-focal] 2026-05-06 01:02:16.410780 | ubuntu-focal | 2026-05-06 01:02:16.410991 | ubuntu-focal | TASK [Populate service facts] ************************************************** 2026-05-06 01:02:16.411188 | ubuntu-focal | Wednesday 06 May 2026 01:02:16 +0000 (0:00:01.737) 0:00:02.739 ********* 2026-05-06 01:02:18.139202 | ubuntu-focal | ok: [ubuntu-focal] 2026-05-06 01:02:18.139311 | ubuntu-focal | 2026-05-06 01:02:18.139453 | ubuntu-focal | TASK [Assert that the NGINX package is not installed] ************************** 2026-05-06 01:02:18.139618 | ubuntu-focal | Wednesday 06 May 2026 01:02:18 +0000 (0:00:01.728) 0:00:04.468 ********* 2026-05-06 01:02:18.164277 | ubuntu-focal | ok: [ubuntu-focal] => { 2026-05-06 01:02:18.164346 | ubuntu-focal | "changed": false, 2026-05-06 01:02:18.164438 | ubuntu-focal | "msg": "All assertions passed" 2026-05-06 01:02:18.164511 | ubuntu-focal | } 2026-05-06 01:02:18.164588 | ubuntu-focal | 2026-05-06 01:02:18.164677 | ubuntu-focal | TASK [Assert that the NGINX service is still up] ******************************* 2026-05-06 01:02:18.164763 | ubuntu-focal | Wednesday 06 May 2026 01:02:18 +0000 (0:00:00.024) 0:00:04.493 ********* 2026-05-06 01:02:18.189549 | ubuntu-focal | ok: [ubuntu-focal] => { 2026-05-06 01:02:18.189661 | ubuntu-focal | "changed": false, 2026-05-06 01:02:18.189770 | ubuntu-focal | "msg": "All assertions passed" 2026-05-06 01:02:18.189855 | ubuntu-focal | } 2026-05-06 01:02:18.189935 | ubuntu-focal | 2026-05-06 01:02:18.190022 | ubuntu-focal | PLAY RECAP ********************************************************************* 2026-05-06 01:02:18.190115 | ubuntu-focal | ubuntu-focal : ok=5 changed=0 unreachable=0 failed=0 skipped=0 rescued=0 ignored=0 2026-05-06 01:02:18.190186 | ubuntu-focal | 2026-05-06 01:02:18.190261 | ubuntu-focal | 2026-05-06 01:02:18.190347 | ubuntu-focal | TASKS RECAP ******************************************************************** 2026-05-06 01:02:18.190423 | ubuntu-focal | Wednesday 06 May 2026 01:02:18 +0000 (0:00:00.025) 0:00:04.519 ********* 2026-05-06 01:02:18.190498 | ubuntu-focal | =============================================================================== 2026-05-06 01:02:18.190578 | ubuntu-focal | Populate package facts -------------------------------------------------- 1.74s 2026-05-06 01:02:18.190655 | ubuntu-focal | Populate service facts -------------------------------------------------- 1.73s 2026-05-06 01:02:18.190737 | ubuntu-focal | Gathering Facts --------------------------------------------------------- 1.00s 2026-05-06 01:02:18.190842 | ubuntu-focal | Assert that the NGINX service is still up ------------------------------- 0.03s 2026-05-06 01:02:18.190928 | ubuntu-focal | Assert that the NGINX package is not installed -------------------------- 0.02s 2026-05-06 01:02:18.294363 | ubuntu-focal | INFO [forget-package > verify] Executed: Successful 2026-05-06 01:02:18.302122 | ubuntu-focal | INFO [forget-package > cleanup] Executing 2026-05-06 01:02:18.302476 | ubuntu-focal | WARNING [forget-package > cleanup] Executed: Missing playbook (Remove from test_sequence to suppress) 2026-05-06 01:02:18.307415 | ubuntu-focal | INFO [forget-package > destroy] Executing 2026-05-06 01:02:18.307487 | ubuntu-focal | WARNING [forget-package > destroy] Skipping, '--destroy=never' requested. 2026-05-06 01:02:18.307549 | ubuntu-focal | INFO [forget-package > destroy] Executed: Successful 2026-05-06 01:02:18.307787 | ubuntu-focal | WARNING Molecule executed 1 scenario (1 missing files) 2026-05-06 01:02:18.452479 | ubuntu-focal | ok: Runtime: 0:01:13.428069 2026-05-06 01:02:18.459092 | 2026-05-06 01:02:18.459254 | PLAY RECAP 2026-05-06 01:02:18.459322 | ubuntu-focal | ok: 3 changed: 3 unreachable: 0 failed: 0 skipped: 0 rescued: 0 ignored: 0 2026-05-06 01:02:18.459352 | 2026-05-06 01:02:18.593379 | RUN END RESULT_NORMAL: [untrusted : github.com/vexxhost/zuul-jobs/playbooks/molecule/run.yaml@main] 2026-05-06 01:02:18.594724 | POST-RUN START: [trusted : github.com/vexxhost/zuul-config/playbooks/base/post.yaml@main] 2026-05-06 01:02:19.243862 | 2026-05-06 01:02:19.244038 | PLAY [all] 2026-05-06 01:02:19.257088 | 2026-05-06 01:02:19.257223 | TASK [fetch-output : Set log path for multiple nodes] 2026-05-06 01:02:19.303213 | ubuntu-focal | skipping: Conditional result was False 2026-05-06 01:02:19.312156 | 2026-05-06 01:02:19.312347 | TASK [fetch-output : Set log path for single node] 2026-05-06 01:02:19.344780 | ubuntu-focal | ok 2026-05-06 01:02:19.351509 | 2026-05-06 01:02:19.351613 | LOOP [fetch-output : Ensure local output dirs] 2026-05-06 01:02:19.738848 | ubuntu-focal -> localhost | ok: "/var/lib/zuul/builds/431935a78a4747da91c6d444409993ba/work/logs" 2026-05-06 01:02:19.956059 | ubuntu-focal -> localhost | changed: "/var/lib/zuul/builds/431935a78a4747da91c6d444409993ba/work/artifacts" 2026-05-06 01:02:20.195133 | ubuntu-focal -> localhost | changed: "/var/lib/zuul/builds/431935a78a4747da91c6d444409993ba/work/docs" 2026-05-06 01:02:20.213127 | 2026-05-06 01:02:20.213325 | LOOP [fetch-output : Collect logs, artifacts and docs] 2026-05-06 01:02:20.813418 | ubuntu-focal | changed: .d..t...... ./ 2026-05-06 01:02:20.813634 | ubuntu-focal | changed: All items complete 2026-05-06 01:02:20.813661 | 2026-05-06 01:02:21.207851 | ubuntu-focal | changed: .d..t...... ./ 2026-05-06 01:02:21.610695 | ubuntu-focal | changed: .d..t...... ./ 2026-05-06 01:02:21.636545 | 2026-05-06 01:02:21.636694 | LOOP [merge-output-to-logs : Move artifacts and docs to logs dir] 2026-05-06 01:02:22.066177 | ubuntu-focal -> localhost | ok: Item: artifacts Runtime: 0:00:00.008670 2026-05-06 01:02:22.293852 | ubuntu-focal -> localhost | ok: Item: docs Runtime: 0:00:00.006805 2026-05-06 01:02:22.315233 | 2026-05-06 01:02:22.315394 | PLAY [all] 2026-05-06 01:02:22.322032 | 2026-05-06 01:02:22.322099 | TASK [remove-build-sshkey : Remove the build SSH key from all nodes] 2026-05-06 01:02:22.722009 | ubuntu-focal | changed 2026-05-06 01:02:22.727550 | 2026-05-06 01:02:22.727601 | PLAY RECAP 2026-05-06 01:02:22.727650 | ubuntu-focal | ok: 5 changed: 4 unreachable: 0 failed: 0 skipped: 1 rescued: 0 ignored: 0 2026-05-06 01:02:22.727672 | 2026-05-06 01:02:22.870309 | POST-RUN END RESULT_NORMAL: [trusted : github.com/vexxhost/zuul-config/playbooks/base/post.yaml@main] 2026-05-06 01:02:22.872006 | POST-RUN START: [trusted : github.com/vexxhost/zuul-config/playbooks/base/post-logs.yaml@main] 2026-05-06 01:02:23.455936 | 2026-05-06 01:02:23.456065 | PLAY [localhost] 2026-05-06 01:02:23.466416 | 2026-05-06 01:02:23.466492 | TASK [Generate Zuul manifest] 2026-05-06 01:02:23.490816 | localhost | ok 2026-05-06 01:02:23.506553 | 2026-05-06 01:02:23.506628 | TASK [generate-zuul-manifest : Generate Zuul manifest] 2026-05-06 01:02:23.885314 | localhost | changed 2026-05-06 01:02:23.898164 | 2026-05-06 01:02:23.898245 | TASK [generate-zuul-manifest : Return Zuul manifest URL to Zuul] 2026-05-06 01:02:23.941561 | localhost | ok 2026-05-06 01:02:23.950494 | 2026-05-06 01:02:23.950560 | TASK [Upload logs] 2026-05-06 01:02:23.968861 | localhost | ok 2026-05-06 01:02:24.026926 | 2026-05-06 01:02:24.027059 | TASK [Set zuul-log-path fact] 2026-05-06 01:02:24.050275 | localhost | ok 2026-05-06 01:02:24.063563 | 2026-05-06 01:02:24.063631 | TASK [set-zuul-log-path-fact : Set log path for a build] 2026-05-06 01:02:24.093674 | localhost | ok 2026-05-06 01:02:24.103367 | 2026-05-06 01:02:24.103483 | TASK [upload-logs : Create log directories] 2026-05-06 01:02:24.523454 | localhost | changed 2026-05-06 01:02:24.529945 | 2026-05-06 01:02:24.530038 | TASK [upload-logs : Ensure logs are readable before uploading] 2026-05-06 01:02:25.051048 | localhost -> localhost | ok: Runtime: 0:00:00.006217 2026-05-06 01:02:25.057470 | 2026-05-06 01:02:25.057591 | TASK [upload-logs : Upload logs to log server] 2026-05-06 01:02:25.528267 | localhost | Output suppressed because no_log was given 2026-05-06 01:02:25.533369 | 2026-05-06 01:02:25.533484 | LOOP [upload-logs : Compress console log and json output] 2026-05-06 01:02:25.591198 | localhost | skipping: Conditional result was False 2026-05-06 01:02:25.598834 | localhost | skipping: Conditional result was False 2026-05-06 01:02:25.615258 | 2026-05-06 01:02:25.615463 | LOOP [upload-logs : Upload compressed console log and json output] 2026-05-06 01:02:25.662570 | localhost | skipping: Conditional result was False 2026-05-06 01:02:25.663227 | 2026-05-06 01:02:25.666644 | localhost | skipping: Conditional result was False 2026-05-06 01:02:25.683190 | 2026-05-06 01:02:25.683407 | LOOP [upload-logs : Upload console log and json output]