2026-02-17 18:50:47.146599 | Job console starting... 2026-02-17 18:50:47.157142 | Updating repositories 2026-02-17 18:50:47.189497 | Preparing job workspace 2026-02-17 18:50:53.144777 | Running Ansible setup... 2026-02-17 18:51:01.025817 | PRE-RUN START: [trusted : review.rdoproject.org/config/playbooks/base-minimal/pre.yaml@master] 2026-02-17 18:51:01.616234 | 2026-02-17 18:51:01.616365 | PLAY [localhost] 2026-02-17 18:51:01.625181 | 2026-02-17 18:51:01.625252 | TASK [Gathering Facts] 2026-02-17 18:51:02.609879 | localhost | ok 2026-02-17 18:51:02.638975 | 2026-02-17 18:51:02.639203 | TASK [log-inventory : Ensure Zuul Ansible directory exists] 2026-02-17 18:51:03.091788 | localhost -> localhost | changed 2026-02-17 18:51:03.097497 | 2026-02-17 18:51:03.097567 | TASK [log-inventory : Copy ansible inventory to logs dir] 2026-02-17 18:51:03.984028 | localhost -> localhost | changed 2026-02-17 18:51:03.992196 | 2026-02-17 18:51:03.992262 | TASK [Setup log path fact] 2026-02-17 18:51:04.009181 | localhost | ok 2026-02-17 18:51:04.020389 | 2026-02-17 18:51:04.020454 | TASK [set-zuul-log-path-fact : Set log path for a build] 2026-02-17 18:51:04.047098 | localhost | ok 2026-02-17 18:51:04.054473 | 2026-02-17 18:51:04.054539 | TASK [emit-job-header : Print job information] 2026-02-17 18:51:04.101682 | # Job Information 2026-02-17 18:51:04.101852 | Ansible Version: 2.15.12 2026-02-17 18:51:04.101888 | Job: cifmw-pod-ansible-test 2026-02-17 18:51:04.101913 | Pipeline: github-check 2026-02-17 18:51:04.101936 | Executor: ze01.softwarefactory-project.io 2026-02-17 18:51:04.101961 | Triggered by: https://github.com/openstack-k8s-operators/ci-framework/pull/3664 2026-02-17 18:51:04.101986 | Log URL (when completed): https://logserver.rdoproject.org/d89/rdoproject.org/d89d64647ee54c49891c353781c0e453/ 2026-02-17 18:51:04.102008 | Event ID: 7fade670-0c31-11f1-99a6-7ba84500a0c0 2026-02-17 18:51:04.105715 | 2026-02-17 18:51:04.105775 | LOOP [emit-job-header : Print node information] 2026-02-17 18:51:04.204413 | localhost | ok: 2026-02-17 18:51:04.204602 | localhost | # Node Information 2026-02-17 18:51:04.204640 | localhost | Inventory Hostname: container 2026-02-17 18:51:04.204668 | localhost | Hostname: b3e0a3deba08 2026-02-17 18:51:04.204693 | localhost | Username: zuul 2026-02-17 18:51:04.204721 | localhost | Distro: CentOS 9 2026-02-17 18:51:04.204744 | localhost | Provider: k1s04 2026-02-17 18:51:04.204766 | localhost | Region: 2026-02-17 18:51:04.204790 | localhost | Label: pod-centos-9-stream 2026-02-17 18:51:04.204813 | localhost | Product Name: OpenStack Nova 2026-02-17 18:51:04.204834 | localhost | Interface IP: pod-centos-9-stream-0005622435 2026-02-17 18:51:04.227759 | 2026-02-17 18:51:04.227887 | PLAY [all] 2026-02-17 18:51:04.233473 | 2026-02-17 18:51:04.233535 | TASK [Gather network facts] 2026-02-17 18:51:09.920067 | container | ok 2026-02-17 18:51:09.947440 | 2026-02-17 18:51:09.947603 | TASK [include_role : start-zuul-console] 2026-02-17 18:51:09.974428 | container | ok 2026-02-17 18:51:09.996989 | 2026-02-17 18:51:09.997146 | TASK [start-zuul-console : Start zuul_console daemon.] 2026-02-17 18:51:15.793410 | container | ok 2026-02-17 18:51:15.804655 | 2026-02-17 18:51:15.804772 | TASK [include_role : add-build-sshkey] 2026-02-17 18:51:15.829703 | container | skipping: Conditional result was False 2026-02-17 18:51:15.836272 | 2026-02-17 18:51:15.836368 | TASK [include_role : validate-host] 2026-02-17 18:51:15.861865 | container | skipping: Conditional result was False 2026-02-17 18:51:15.868574 | 2026-02-17 18:51:15.868667 | TASK [include_role : prepare-workspace-openshift] 2026-02-17 18:51:15.900038 | container | ok 2026-02-17 18:51:15.915250 | 2026-02-17 18:51:15.915373 | LOOP [prepare-workspace-openshift : include_tasks] 2026-02-17 18:51:15.991644 | container | ok: 2026-02-17 18:51:15.992108 | container | [ 2026-02-17 18:51:15.992183 | container | "container", 2026-02-17 18:51:15.992239 | container | { 2026-02-17 18:51:15.992286 | container | "context": "main:zuul-worker/38-102-83-54:9023", 2026-02-17 18:51:15.992332 | container | "namespace": "main", 2026-02-17 18:51:15.992488 | container | "pod": "pod-centos-9-stream-0005622435", 2026-02-17 18:51:15.992537 | container | "stream_port": "37159" 2026-02-17 18:51:15.992574 | container | } 2026-02-17 18:51:15.992609 | container | ] 2026-02-17 18:51:15.992673 | container | ok: All items complete 2026-02-17 18:51:15.992717 | 2026-02-17 18:51:16.017549 | container | included: /var/lib/zuul/builds/d89d64647ee54c49891c353781c0e453/trusted/project_0/review.rdoproject.org/config/roles/prepare-workspace-openshift/tasks/rsync.yaml 2026-02-17 18:51:16.030546 | 2026-02-17 18:51:16.030718 | TASK [prepare-workspace-openshift : Create src directory] 2026-02-17 18:51:17.318635 | container -> localhost | ok: Runtime: 0:00:00.798001 2026-02-17 18:51:17.330669 | 2026-02-17 18:51:17.330822 | TASK [prepare-workspace-openshift : Copy src repos to the pod] 2026-02-17 18:51:30.363363 | container -> localhost | Output suppressed because no_log was given 2026-02-17 18:51:30.372059 | 2026-02-17 18:51:30.372161 | TASK [include_role : remove-zuul-sshkey] 2026-02-17 18:51:30.401818 | container | ok 2026-02-17 18:51:30.415990 | 2026-02-17 18:51:30.416125 | TASK [remove-zuul-sshkey : Remove master key from local agent] 2026-02-17 18:51:30.755462 | container -> localhost | changed 2026-02-17 18:51:30.769746 | 2026-02-17 18:51:30.769867 | LOOP [ensure-output-dirs : Empty Zuul Output directories by removing them] 2026-02-17 18:51:36.542665 | container | ok: "logs" 2026-02-17 18:51:42.681073 | container | ok: "artifacts" 2026-02-17 18:51:48.652645 | container | ok: "docs" 2026-02-17 18:51:48.668461 | 2026-02-17 18:51:48.668669 | LOOP [ensure-output-dirs : Ensure Zuul Output directories exist] 2026-02-17 18:51:54.745278 | container | changed: "logs" 2026-02-17 18:51:54.745698 | container | ok: All items complete 2026-02-17 18:51:54.745764 | 2026-02-17 18:52:00.535762 | container | changed: "artifacts" 2026-02-17 18:52:06.581605 | container | changed: "docs" 2026-02-17 18:52:06.637179 | 2026-02-17 18:52:06.637302 | PLAY RECAP 2026-02-17 18:52:06.637356 | container | ok: 8 changed: 4 unreachable: 0 failed: 0 skipped: 2 rescued: 0 ignored: 0 2026-02-17 18:52:06.637392 | localhost | ok: 6 changed: 2 unreachable: 0 failed: 0 skipped: 0 rescued: 0 ignored: 0 2026-02-17 18:52:06.637418 | 2026-02-17 18:52:06.734343 | PRE-RUN END RESULT_NORMAL: [trusted : review.rdoproject.org/config/playbooks/base-minimal/pre.yaml@master] 2026-02-17 18:52:06.735837 | PRE-RUN START: [untrusted : review.rdoproject.org/rdo-jobs/playbooks/base/pre.yaml@master] 2026-02-17 18:52:07.300821 | 2026-02-17 18:52:07.300951 | PLAY [localhost] 2026-02-17 18:52:07.316996 | 2026-02-17 18:52:07.317118 | TASK [configure-ssh-config-fips : Ensure ssh config directory] 2026-02-17 18:52:07.768730 | localhost | ok 2026-02-17 18:52:07.779774 | 2026-02-17 18:52:07.779964 | TASK [configure-ssh-config-fips : Setup ssh config] 2026-02-17 18:52:08.536161 | localhost | changed 2026-02-17 18:52:08.579803 | 2026-02-17 18:52:08.579912 | PLAY [all] 2026-02-17 18:52:08.598520 | 2026-02-17 18:52:08.598606 | TASK [include_role : prepare-workspace] 2026-02-17 18:52:08.623272 | container | skipping: Conditional result was False 2026-02-17 18:52:08.635356 | 2026-02-17 18:52:08.635549 | LOOP [ensure-output-dirs : Empty Zuul Output directories by removing them] 2026-02-17 18:52:16.180842 | container | changed: "logs" 2026-02-17 18:52:26.513575 | container | changed: "artifacts" 2026-02-17 18:52:34.345488 | container | changed: "docs" 2026-02-17 18:52:34.361707 | 2026-02-17 18:52:34.361892 | LOOP [ensure-output-dirs : Ensure Zuul Output directories exist] 2026-02-17 18:52:40.647945 | container | changed: "logs" 2026-02-17 18:52:40.648252 | container | changed: All items complete 2026-02-17 18:52:40.648280 | 2026-02-17 18:52:46.716940 | container | changed: "artifacts" 2026-02-17 18:52:52.538530 | container | changed: "docs" 2026-02-17 18:52:52.563562 | 2026-02-17 18:52:52.563757 | TASK [Check if worker can sudo] 2026-02-17 18:52:58.910847 | container | ok: Runtime: 0:00:00.040185 2026-02-17 18:52:58.921982 | 2026-02-17 18:52:58.922164 | TASK [configure-mirrors : Gather needed facts] 2026-02-17 18:52:58.939009 | container | skipping: Conditional result was False 2026-02-17 18:52:58.951111 | 2026-02-17 18:52:58.951269 | TASK [configure-mirrors : Set up infrastructure mirrors] 2026-02-17 18:52:58.967927 | container | skipping: Conditional result was False 2026-02-17 18:52:59.007420 | 2026-02-17 18:52:59.007524 | PLAY RECAP 2026-02-17 18:52:59.007582 | container | ok: 3 changed: 2 unreachable: 0 failed: 0 skipped: 3 rescued: 0 ignored: 0 2026-02-17 18:52:59.007622 | localhost | ok: 2 changed: 1 unreachable: 0 failed: 0 skipped: 0 rescued: 0 ignored: 0 2026-02-17 18:52:59.007650 | 2026-02-17 18:52:59.106724 | PRE-RUN END RESULT_NORMAL: [untrusted : review.rdoproject.org/rdo-jobs/playbooks/base/pre.yaml@master] 2026-02-17 18:52:59.107543 | RUN START: [untrusted : github.com/openstack-k8s-operators/ci-framework/ci/playbooks/pod-jobs.yml@main] 2026-02-17 18:52:59.708376 | 2026-02-17 18:52:59.708484 | PLAY [Run light checks in pod] 2026-02-17 18:52:59.726999 | 2026-02-17 18:52:59.727107 | TASK [Install packages] 2026-02-17 18:53:32.199098 | container | ok: Nothing to do 2026-02-17 18:53:32.209318 | 2026-02-17 18:53:32.209465 | TASK [Ensure zuul-output exists] 2026-02-17 18:53:37.953743 | container | ok 2026-02-17 18:53:37.963800 | 2026-02-17 18:53:37.963935 | TASK [Install dependencies] 2026-02-17 18:55:12.723437 | container | changed 2026-02-17 18:55:12.752905 | 2026-02-17 18:55:12.753006 | TASK [Run check] 2026-02-17 19:21:09.169806 | RUN END RESULT_TIMED_OUT: [untrusted : github.com/openstack-k8s-operators/ci-framework/ci/playbooks/pod-jobs.yml@main] 2026-02-17 19:21:09.172960 | POST-RUN START: [trusted : review.rdoproject.org/config/playbooks/base-minimal/post-ssh.yaml@master] 2026-02-17 19:21:09.817392 | 2026-02-17 19:21:09.817590 | PLAY [all] 2026-02-17 19:21:09.835436 | 2026-02-17 19:21:09.835533 | TASK [include_role : fetch-output] 2026-02-17 19:21:09.859526 | container | skipping: Conditional result was False 2026-02-17 19:21:09.864571 | 2026-02-17 19:21:09.864641 | TASK [include_role : fetch-output-openshift] 2026-02-17 19:21:09.903517 | container | ok 2026-02-17 19:21:09.920519 | 2026-02-17 19:21:09.920618 | TASK [fetch-output-openshift : Set log path for multiple nodes] 2026-02-17 19:21:09.995426 | container | skipping: Conditional result was False 2026-02-17 19:21:10.007795 | 2026-02-17 19:21:10.007951 | TASK [fetch-output-openshift : Set log path for single node] 2026-02-17 19:21:10.064622 | container | ok 2026-02-17 19:21:10.074660 | 2026-02-17 19:21:10.074835 | LOOP [fetch-output-openshift : Ensure local output dirs] 2026-02-17 19:21:10.537844 | container -> localhost | ok: "/var/lib/zuul/builds/d89d64647ee54c49891c353781c0e453/work/logs" 2026-02-17 19:21:10.782993 | container -> localhost | changed: "/var/lib/zuul/builds/d89d64647ee54c49891c353781c0e453/work/logs/npm" 2026-02-17 19:21:11.061091 | container -> localhost | changed: "/var/lib/zuul/builds/d89d64647ee54c49891c353781c0e453/work/artifacts" 2026-02-17 19:21:11.303985 | container -> localhost | changed: "/var/lib/zuul/builds/d89d64647ee54c49891c353781c0e453/work/docs" 2026-02-17 19:21:11.341727 | 2026-02-17 19:21:11.342130 | LOOP [fetch-output-openshift : include_tasks] 2026-02-17 19:21:11.398837 | container | ok: 2026-02-17 19:21:11.399551 | container | [ 2026-02-17 19:21:11.399626 | container | "container", 2026-02-17 19:21:11.399667 | container | { 2026-02-17 19:21:11.399704 | container | "context": "main:zuul-worker/38-102-83-54:9023", 2026-02-17 19:21:11.399742 | container | "namespace": "main", 2026-02-17 19:21:11.399778 | container | "pod": "pod-centos-9-stream-0005622435", 2026-02-17 19:21:11.399813 | container | "stream_port": "37159" 2026-02-17 19:21:11.399848 | container | } 2026-02-17 19:21:11.399883 | container | ] 2026-02-17 19:21:11.399944 | container | changed: All items complete 2026-02-17 19:21:11.399986 | 2026-02-17 19:21:11.418934 | container | included: /var/lib/zuul/builds/d89d64647ee54c49891c353781c0e453/trusted/project_0/review.rdoproject.org/config/roles/fetch-output-openshift/tasks/rsync.yaml 2026-02-17 19:21:11.432605 | 2026-02-17 19:21:11.432945 | LOOP [fetch-output-openshift : Ensure local directory exists] 2026-02-17 19:21:17.548915 | container | changed: "/var/lib/zuul/builds/d89d64647ee54c49891c353781c0e453/work/logs" 2026-02-17 19:21:26.089664 | container | changed: "/var/lib/zuul/builds/d89d64647ee54c49891c353781c0e453/work/logs/npm" 2026-02-17 19:21:31.720529 | container | changed: "/var/lib/zuul/builds/d89d64647ee54c49891c353781c0e453/work/artifacts" 2026-02-17 19:21:37.800306 | container | changed: "/var/lib/zuul/builds/d89d64647ee54c49891c353781c0e453/work/docs" 2026-02-17 19:21:37.827650 | 2026-02-17 19:21:37.827914 | LOOP [fetch-output-openshift : Copy zuul-output from the pod to the executor] 2026-02-17 19:21:43.125295 | container | Output suppressed because no_log was given 2026-02-17 19:21:43.130506 | 2026-02-17 19:21:43.130568 | TASK [fetch-output-openshift : Remove empty directory] 2026-02-17 19:21:43.468737 | container -> localhost | ok: Runtime: 0:00:00.044817 2026-02-17 19:21:43.485701 | 2026-02-17 19:21:43.485829 | LOOP [merge-output-to-logs : Move artifacts and docs to logs dir] 2026-02-17 19:21:43.794413 | container -> localhost | find: ‘/var/lib/zuul/builds/d89d64647ee54c49891c353781c0e453/work/artifacts’: No such file or directory 2026-02-17 19:21:43.794634 | container -> localhost | find: ‘/var/lib/zuul/builds/d89d64647ee54c49891c353781c0e453/work/artifacts’: No such file or directory 2026-02-17 19:21:43.794681 | container -> localhost | ok: Item: artifacts Runtime: 0:00:00.011971 2026-02-17 19:21:43.794715 | container -> localhost | changed: All items complete 2026-02-17 19:21:43.794736 | 2026-02-17 19:21:44.095684 | container -> localhost | find: ‘/var/lib/zuul/builds/d89d64647ee54c49891c353781c0e453/work/docs’: No such file or directory 2026-02-17 19:21:44.095843 | container -> localhost | find: ‘/var/lib/zuul/builds/d89d64647ee54c49891c353781c0e453/work/docs’: No such file or directory 2026-02-17 19:21:44.095912 | container -> localhost | ok: Item: docs Runtime: 0:00:00.009186 2026-02-17 19:21:44.123883 | 2026-02-17 19:21:44.123993 | PLAY [all] 2026-02-17 19:21:44.136871 | 2026-02-17 19:21:44.136953 | TASK [remove-build-sshkey : Remove the build SSH key from all nodes] 2026-02-17 19:21:44.176444 | container | ERROR 2026-02-17 19:21:44.176663 | container | { 2026-02-17 19:21:44.176691 | container | "msg": "The 'file' lookup had an issue accessing the file '/var/lib/zuul/builds/d89d64647ee54c49891c353781c0e453/work/src/../d89d64647ee54c49891c353781c0e453_id_rsa.pub'. file not found, use -vvvvv to see paths searched" 2026-02-17 19:21:44.176713 | container | } 2026-02-17 19:21:44.176738 | container | ERROR: Ignoring Errors 2026-02-17 19:21:44.199348 | 2026-02-17 19:21:44.199462 | PLAY RECAP 2026-02-17 19:21:44.199507 | container | ok: 8 changed: 5 unreachable: 0 failed: 0 skipped: 2 rescued: 0 ignored: 1 2026-02-17 19:21:44.199528 | 2026-02-17 19:21:44.297367 | POST-RUN END RESULT_NORMAL: [trusted : review.rdoproject.org/config/playbooks/base-minimal/post-ssh.yaml@master] 2026-02-17 19:21:44.298715 | POST-RUN START: [trusted : review.rdoproject.org/config/playbooks/base-minimal/post-logs.yaml@master] 2026-02-17 19:21:44.909966 | 2026-02-17 19:21:44.910139 | PLAY [localhost] 2026-02-17 19:21:44.927611 | 2026-02-17 19:21:44.927690 | TASK [generate-zuul-manifest : Generate Zuul manifest] 2026-02-17 19:21:45.351990 | localhost | changed 2026-02-17 19:21:45.356588 | 2026-02-17 19:21:45.356665 | TASK [generate-zuul-manifest : Return Zuul manifest URL to Zuul] 2026-02-17 19:21:45.386294 | localhost | ok 2026-02-17 19:21:45.397361 | 2026-02-17 19:21:45.397460 | TASK [add-fileserver : Create SSH private key tempfile] 2026-02-17 19:21:45.756222 | localhost | changed 2026-02-17 19:21:45.768465 | 2026-02-17 19:21:45.768642 | TASK [add-fileserver : Create SSH private key from secret] 2026-02-17 19:21:46.472956 | localhost | changed 2026-02-17 19:21:46.492509 | 2026-02-17 19:21:46.492610 | TASK [add-fileserver : Add fileserver ssh key] 2026-02-17 19:21:46.956113 | localhost | Identity added: /var/lib/zuul/builds/d89d64647ee54c49891c353781c0e453/work/tmp/ansible.771dkiit (/var/lib/zuul/builds/d89d64647ee54c49891c353781c0e453/work/tmp/ansible.771dkiit) 2026-02-17 19:21:46.956483 | localhost | ok: Runtime: 0:00:00.013009 2026-02-17 19:21:46.970372 | 2026-02-17 19:21:46.970517 | TASK [add-fileserver : Remove SSH private key from disk] 2026-02-17 19:21:47.279742 | localhost | ok: Runtime: 0:00:00.008900 2026-02-17 19:21:47.290478 | 2026-02-17 19:21:47.290630 | TASK [add-fileserver : Add fileserver to inventory] 2026-02-17 19:21:47.359646 | localhost | changed 2026-02-17 19:21:47.369143 | 2026-02-17 19:21:47.369289 | TASK [add-fileserver : Add fileserver server to known hosts] 2026-02-17 19:21:47.844649 | localhost | changed 2026-02-17 19:21:47.886433 | 2026-02-17 19:21:47.886647 | PLAY [localhost] 2026-02-17 19:21:47.914279 | 2026-02-17 19:21:47.914414 | TASK [Generate bulk log download script] 2026-02-17 19:21:47.939417 | localhost | ok 2026-02-17 19:21:47.968627 | 2026-02-17 19:21:47.968776 | TASK [local-log-download : Check API endpoint is defined] 2026-02-17 19:21:48.014193 | localhost | ok: All assertions passed 2026-02-17 19:21:48.023961 | 2026-02-17 19:21:48.024137 | TASK [local-log-download : Create download script] 2026-02-17 19:21:48.500267 | localhost -> localhost | changed 2026-02-17 19:21:48.522844 | 2026-02-17 19:21:48.523080 | TASK [Register quick-download link] 2026-02-17 19:21:48.561698 | localhost | ok 2026-02-17 19:21:48.632113 | 2026-02-17 19:21:48.632239 | PLAY [logserver.rdoproject.org] 2026-02-17 19:21:48.642438 | 2026-02-17 19:21:48.642522 | TASK [Set zuul-log-path fact] 2026-02-17 19:21:48.671250 | logserver.rdoproject.org | ok 2026-02-17 19:21:48.685232 | 2026-02-17 19:21:48.685335 | TASK [set-zuul-log-path-fact : Set log path for a build] 2026-02-17 19:21:48.724903 | logserver.rdoproject.org | ok 2026-02-17 19:21:48.732630 | 2026-02-17 19:21:48.732723 | TASK [upload-logs : Create log directories] 2026-02-17 19:21:49.594149 | logserver.rdoproject.org | changed 2026-02-17 19:21:49.601191 | 2026-02-17 19:21:49.601330 | TASK [upload-logs : Ensure logs are readable before uploading] 2026-02-17 19:21:49.915776 | logserver.rdoproject.org -> localhost | ok: Runtime: 0:00:00.009991 2026-02-17 19:21:49.921972 | 2026-02-17 19:21:49.922075 | TASK [upload-logs : Upload logs to log server] 2026-02-17 19:21:50.702921 | logserver.rdoproject.org | Output suppressed because no_log was given 2026-02-17 19:21:50.710717 | 2026-02-17 19:21:50.710918 | LOOP [upload-logs : Compress console log and json output] 2026-02-17 19:21:50.779255 | logserver.rdoproject.org | skipping: Conditional result was False 2026-02-17 19:21:50.791848 | logserver.rdoproject.org | skipping: Conditional result was False 2026-02-17 19:21:50.808991 | 2026-02-17 19:21:50.809325 | LOOP [upload-logs : Upload compressed console log and json output] 2026-02-17 19:21:50.855656 | logserver.rdoproject.org | skipping: Conditional result was False 2026-02-17 19:21:50.856187 | 2026-02-17 19:21:50.858693 | logserver.rdoproject.org | skipping: Conditional result was False 2026-02-17 19:21:50.868263 | 2026-02-17 19:21:50.868537 | LOOP [upload-logs : Upload console log and json output]