2026-01-20 16:36:57.775125 | Job console starting... 2026-01-20 16:36:57.994405 | Updating repositories 2026-01-20 16:36:58.737822 | Preparing job workspace 2026-01-20 16:37:16.542468 | Running Ansible setup... 2026-01-20 16:37:23.236822 | PRE-RUN START: [trusted : review.rdoproject.org/config/playbooks/base-minimal/pre.yaml@master] 2026-01-20 16:37:24.871846 | 2026-01-20 16:37:24.871964 | PLAY [localhost] 2026-01-20 16:37:24.897886 | 2026-01-20 16:37:24.897955 | TASK [Gathering Facts] 2026-01-20 16:37:27.086881 | localhost | ok 2026-01-20 16:37:27.132864 | 2026-01-20 16:37:27.132982 | TASK [log-inventory : Ensure Zuul Ansible directory exists] 2026-01-20 16:37:28.447634 | localhost -> localhost | changed 2026-01-20 16:37:28.452507 | 2026-01-20 16:37:28.452587 | TASK [log-inventory : Copy ansible inventory to logs dir] 2026-01-20 16:37:31.170790 | localhost -> localhost | changed 2026-01-20 16:37:31.179632 | 2026-01-20 16:37:31.179715 | TASK [Setup log path fact] 2026-01-20 16:37:31.230232 | localhost | ok 2026-01-20 16:37:31.254336 | 2026-01-20 16:37:31.254409 | TASK [set-zuul-log-path-fact : Set log path for a build] 2026-01-20 16:37:31.332345 | localhost | ok 2026-01-20 16:37:31.347949 | 2026-01-20 16:37:31.348022 | TASK [emit-job-header : Print job information] 2026-01-20 16:37:31.421213 | # Job Information 2026-01-20 16:37:31.421414 | Ansible Version: 2.15.12 2026-01-20 16:37:31.421449 | Job: cifmw-molecule-ci_multus 2026-01-20 16:37:31.421473 | Pipeline: github-check 2026-01-20 16:37:31.421494 | Executor: ibm-bm4-ze.softwarefactory-project.io 2026-01-20 16:37:31.421514 | Triggered by: https://github.com/openstack-k8s-operators/ci-framework/pull/3451 2026-01-20 16:37:31.421533 | Log URL (when completed): https://logserver.rdoproject.org/559/rdoproject.org/559949fc17d34b658e1f4a2b497a9a66/ 2026-01-20 16:37:31.421553 | Event ID: 1110c990-f61e-11f0-91a3-9d3a1ada832b 2026-01-20 16:37:31.424988 | 2026-01-20 16:37:31.425049 | LOOP [emit-job-header : Print node information] 2026-01-20 16:37:31.647408 | localhost | ok: 2026-01-20 16:37:31.647547 | localhost | # Node Information 2026-01-20 16:37:31.647579 | localhost | Inventory Hostname: controller 2026-01-20 16:37:31.647604 | localhost | Hostname: np0005589148 2026-01-20 16:37:31.647625 | localhost | Username: zuul 2026-01-20 16:37:31.647646 | localhost | Distro: CentOS 9 2026-01-20 16:37:31.647666 | localhost | Provider: ibm-bm4-nodepool 2026-01-20 16:37:31.647684 | localhost | Region: regionOne 2026-01-20 16:37:31.647702 | localhost | Label: centos-9-stream-crc-2-48-0-xxl 2026-01-20 16:37:31.647719 | localhost | Product Name: OpenStack Compute 2026-01-20 16:37:31.647737 | localhost | Interface IP: 192.168.26.140 2026-01-20 16:37:31.704600 | 2026-01-20 16:37:31.704693 | PLAY [all] 2026-01-20 16:37:31.716612 | 2026-01-20 16:37:31.716675 | TASK [Gather network facts] 2026-01-20 16:37:32.212165 | controller | ok 2026-01-20 16:37:32.274525 | 2026-01-20 16:37:32.274627 | TASK [include_role : start-zuul-console] 2026-01-20 16:37:32.330483 | controller | ok 2026-01-20 16:37:32.381115 | 2026-01-20 16:37:32.381216 | TASK [start-zuul-console : Start zuul_console daemon.] 2026-01-20 16:37:33.129450 | controller | ok 2026-01-20 16:37:33.145051 | 2026-01-20 16:37:33.145146 | TASK [include_role : add-build-sshkey] 2026-01-20 16:37:33.221456 | controller | ok 2026-01-20 16:37:33.268445 | 2026-01-20 16:37:33.268535 | TASK [add-build-sshkey : Check to see if ssh key was already created for this build] 2026-01-20 16:37:34.498943 | controller -> localhost | ok 2026-01-20 16:37:34.504165 | 2026-01-20 16:37:34.504239 | TASK [add-build-sshkey : Create a new key in workspace based on build UUID] 2026-01-20 16:37:34.556017 | controller | ok 2026-01-20 16:37:34.586051 | controller | included: /var/lib/zuul/builds/559949fc17d34b658e1f4a2b497a9a66/trusted/project_1/opendev.org/zuul/zuul-jobs/roles/add-build-sshkey/tasks/create-key-and-replace.yaml 2026-01-20 16:37:34.611308 | 2026-01-20 16:37:34.611382 | TASK [add-build-sshkey : Create Temp SSH key] 2026-01-20 16:37:37.402360 | controller -> localhost | Generating public/private rsa key pair. 2026-01-20 16:37:37.402538 | controller -> localhost | Your identification has been saved in /var/lib/zuul/builds/559949fc17d34b658e1f4a2b497a9a66/work/559949fc17d34b658e1f4a2b497a9a66_id_rsa. 2026-01-20 16:37:37.402577 | controller -> localhost | Your public key has been saved in /var/lib/zuul/builds/559949fc17d34b658e1f4a2b497a9a66/work/559949fc17d34b658e1f4a2b497a9a66_id_rsa.pub. 2026-01-20 16:37:37.402602 | controller -> localhost | The key fingerprint is: 2026-01-20 16:37:37.402624 | controller -> localhost | SHA256:3aV8yspfHte9LZLrWVOKaLqx5zgrFV3CBV1E3vurPOQ zuul-build-sshkey 2026-01-20 16:37:37.402645 | controller -> localhost | The key's randomart image is: 2026-01-20 16:37:37.402665 | controller -> localhost | +---[RSA 3072]----+ 2026-01-20 16:37:37.402684 | controller -> localhost | | ..+.++ | 2026-01-20 16:37:37.402703 | controller -> localhost | | o o. . | 2026-01-20 16:37:37.402721 | controller -> localhost | | . o o .| 2026-01-20 16:37:37.402741 | controller -> localhost | | ...o o .| 2026-01-20 16:37:37.402760 | controller -> localhost | | S.. + ...| 2026-01-20 16:37:37.402778 | controller -> localhost | | . o = o+| 2026-01-20 16:37:37.402796 | controller -> localhost | | .. o *.* =| 2026-01-20 16:37:37.402814 | controller -> localhost | | . .B..+E.++| 2026-01-20 16:37:37.402832 | controller -> localhost | | .**+o==++.| 2026-01-20 16:37:37.402851 | controller -> localhost | +----[SHA256]-----+ 2026-01-20 16:37:37.402895 | controller -> localhost | ok: Runtime: 0:00:01.122733 2026-01-20 16:37:37.408390 | 2026-01-20 16:37:37.408459 | TASK [add-build-sshkey : Remote setup ssh keys (linux)] 2026-01-20 16:37:37.502488 | controller | ok 2026-01-20 16:37:37.551188 | controller | included: /var/lib/zuul/builds/559949fc17d34b658e1f4a2b497a9a66/trusted/project_1/opendev.org/zuul/zuul-jobs/roles/add-build-sshkey/tasks/remote-linux.yaml 2026-01-20 16:37:37.616882 | 2026-01-20 16:37:37.616972 | TASK [add-build-sshkey : Remove previously added zuul-build-sshkey] 2026-01-20 16:37:37.720098 | controller | skipping: Conditional result was False 2026-01-20 16:37:37.725726 | 2026-01-20 16:37:37.725806 | TASK [add-build-sshkey : Enable access via build key on all nodes] 2026-01-20 16:37:38.748898 | controller | changed 2026-01-20 16:37:38.755239 | 2026-01-20 16:37:38.759339 | TASK [add-build-sshkey : Make sure user has a .ssh] 2026-01-20 16:37:39.156661 | controller | ok 2026-01-20 16:37:39.167895 | 2026-01-20 16:37:39.167969 | TASK [add-build-sshkey : Install build private key as SSH key on all nodes] 2026-01-20 16:37:40.746950 | controller | changed 2026-01-20 16:37:40.751582 | 2026-01-20 16:37:40.751644 | TASK [add-build-sshkey : Install build public key as SSH key on all nodes] 2026-01-20 16:37:42.303976 | controller | changed 2026-01-20 16:37:42.314206 | 2026-01-20 16:37:42.314272 | TASK [add-build-sshkey : Remote setup ssh keys (windows)] 2026-01-20 16:37:42.380828 | controller | skipping: Conditional result was False 2026-01-20 16:37:42.386904 | 2026-01-20 16:37:42.386971 | TASK [remove-zuul-sshkey : Remove master key from local agent] 2026-01-20 16:37:43.623350 | controller -> localhost | changed 2026-01-20 16:37:43.635006 | 2026-01-20 16:37:43.635071 | TASK [add-build-sshkey : Add back temp key] 2026-01-20 16:37:44.672727 | controller -> localhost | Identity added: /var/lib/zuul/builds/559949fc17d34b658e1f4a2b497a9a66/work/559949fc17d34b658e1f4a2b497a9a66_id_rsa (zuul-build-sshkey) 2026-01-20 16:37:44.672896 | controller -> localhost | ok: Runtime: 0:00:00.019750 2026-01-20 16:37:44.678463 | 2026-01-20 16:37:44.678529 | TASK [add-build-sshkey : Verify we can still SSH to all nodes] 2026-01-20 16:37:45.335792 | controller | ok 2026-01-20 16:37:45.340508 | 2026-01-20 16:37:45.340574 | TASK [add-build-sshkey : Verify we can still SSH to all nodes (windows)] 2026-01-20 16:37:45.462839 | controller | skipping: Conditional result was False 2026-01-20 16:37:45.498805 | 2026-01-20 16:37:45.498915 | TASK [include_role : validate-host] 2026-01-20 16:37:45.581690 | controller | ok 2026-01-20 16:37:45.660684 | 2026-01-20 16:37:45.660777 | TASK [validate-host : Define zuul_info_dir fact] 2026-01-20 16:37:45.765148 | controller | ok 2026-01-20 16:37:45.793590 | 2026-01-20 16:37:45.793669 | TASK [validate-host : Ensure Zuul Ansible directory exists] 2026-01-20 16:37:46.649139 | controller -> localhost | ok 2026-01-20 16:37:46.655843 | 2026-01-20 16:37:46.655919 | TASK [validate-host : Collect information about the host] 2026-01-20 16:37:47.432562 | controller | ok 2026-01-20 16:37:47.459167 | 2026-01-20 16:37:47.459245 | TASK [validate-host : Sanitize hostname] 2026-01-20 16:37:47.700564 | controller | ok 2026-01-20 16:37:47.705670 | 2026-01-20 16:37:47.705732 | TASK [validate-host : Write out all ansible variables/facts known for each host] 2026-01-20 16:37:48.926511 | controller -> localhost | changed 2026-01-20 16:37:48.931803 | 2026-01-20 16:37:48.931939 | TASK [validate-host : Collect information about zuul worker] 2026-01-20 16:37:49.789438 | controller | ok 2026-01-20 16:37:49.794276 | 2026-01-20 16:37:49.794365 | TASK [validate-host : Write out all zuul information for each host] 2026-01-20 16:37:51.108108 | controller -> localhost | changed 2026-01-20 16:37:51.117443 | 2026-01-20 16:37:51.117523 | TASK [include_role : prepare-workspace-openshift] 2026-01-20 16:37:51.184002 | controller | skipping: Conditional result was False 2026-01-20 16:37:51.190064 | 2026-01-20 16:37:51.190154 | TASK [include_role : remove-zuul-sshkey] 2026-01-20 16:37:51.268029 | controller | skipping: Conditional result was False 2026-01-20 16:37:51.274222 | 2026-01-20 16:37:51.274315 | LOOP [ensure-output-dirs : Empty Zuul Output directories by removing them] 2026-01-20 16:37:51.640543 | controller | ok: "logs" 2026-01-20 16:37:51.640745 | controller | ok: All items complete 2026-01-20 16:37:51.640782 | 2026-01-20 16:37:51.889521 | controller | ok: "artifacts" 2026-01-20 16:37:52.151583 | controller | ok: "docs" 2026-01-20 16:37:52.166694 | 2026-01-20 16:37:52.166790 | LOOP [ensure-output-dirs : Ensure Zuul Output directories exist] 2026-01-20 16:37:52.628625 | controller | changed: "logs" 2026-01-20 16:37:52.903965 | controller | changed: "artifacts" 2026-01-20 16:37:53.190173 | controller | changed: "docs" 2026-01-20 16:37:53.253060 | 2026-01-20 16:37:53.253146 | PLAY RECAP 2026-01-20 16:37:53.253190 | controller | ok: 22 changed: 9 unreachable: 0 failed: 0 skipped: 5 rescued: 0 ignored: 0 2026-01-20 16:37:53.253218 | localhost | ok: 6 changed: 2 unreachable: 0 failed: 0 skipped: 0 rescued: 0 ignored: 0 2026-01-20 16:37:53.253236 | 2026-01-20 16:37:53.751225 | PRE-RUN END RESULT_NORMAL: [trusted : review.rdoproject.org/config/playbooks/base-minimal/pre.yaml@master] 2026-01-20 16:37:53.753981 | PRE-RUN START: [trusted : review.rdoproject.org/config/playbooks/ci-framework-rdo-base/pre.yaml@master] 2026-01-20 16:37:56.926341 | 2026-01-20 16:37:56.926439 | PLAY [all] 2026-01-20 16:37:56.985831 | 2026-01-20 16:37:56.985913 | TASK [mirror-info-fork : Set mirror_fqdn if not defined] 2026-01-20 16:37:57.089174 | controller | ok 2026-01-20 16:37:57.095413 | 2026-01-20 16:37:57.095490 | TASK [mirror-info-fork : Create /etc/ci] 2026-01-20 16:37:58.222644 | controller | changed 2026-01-20 16:37:58.228260 | 2026-01-20 16:37:58.238412 | TASK [mirror-info-fork : Install ci_mirror script] 2026-01-20 16:38:00.879282 | controller | changed 2026-01-20 16:38:00.946179 | 2026-01-20 16:38:00.946313 | LOOP [add-authorized-keys : Enable access via build key on all nodes] 2026-01-20 16:38:02.068539 | controller | changed: 2026-01-20 16:38:02.068706 | controller | { 2026-01-20 16:38:02.068748 | controller | "public_key": "ssh-rsa AAAAB3NzaC1yc2EAAAABIwAAAQEA4Z/c9osaGGtU6X8fgELwfj/yayRurfcKA0HMFfdpPxev2dbwljysMuzoVp4OZmW1gvGtyYPSNRvnzgsaabPNKNo2ym5NToCP6UM+KSe93aln4BcM/24mXChYAbXJQ5Bqq/pIzsGs/pKetQN+vwvMxLOwTvpcsCJBXaa981RKML6xj9l/UZ7IIq1HSEKMvPLxZMWdu0Ut8DkCd5F4nOw9Wgml2uYpDCj5LLCrQQ9ChdOMz8hz6SighhNlRpPkvPaet3OXxr/ytFMu7j7vv06CaEnuMMiY2aTWN1Imin9eHAylIqFHta/3gFfQSWt9jXM7owkBLKL7ATzhaAn+fjNupw== arxcruz@redhat.com" 2026-01-20 16:38:02.068777 | controller | } 2026-01-20 16:38:02.425565 | controller | changed: 2026-01-20 16:38:02.425649 | controller | { 2026-01-20 16:38:02.425679 | controller | "public_key": "ssh-rsa AAAAB3NzaC1yc2EAAAADAQABAAABAQDS4Fn6k4deCnIlOtLWqZJyksbepjQt04j8Ed8CGx9EKkj0fKiAxiI4TadXQYPuNHMixZy4Nevjb6aDhL5Z906TfvNHKUrjrG7G26a0k8vdc61NEQ7FmcGMWRLwwc6ReDO7lFpzYKBMk4YqfWgBuGU/K6WLKiVW2cVvwIuGIaYrE1OiiX0iVUUk7KApXlDJMXn7qjSYynfO4mF629NIp8FJal38+Kv+HA+0QkE5Y2xXnzD4Lar5+keymiCHRntPppXHeLIRzbt0gxC7v3L72hpQ3BTBEzwHpeS8KY+SX1y5lRMN45thCHfJqGmARJREDjBvWG8JXOPmVIKQtZmVcD5b mandreou@redhat.com" 2026-01-20 16:38:02.425703 | controller | } 2026-01-20 16:38:02.745490 | controller | changed: 2026-01-20 16:38:02.745567 | controller | { 2026-01-20 16:38:02.745596 | controller | "public_key": "ssh-rsa AAAAB3NzaC1yc2EAAAADAQABAAABAQC9MiLfy30deHA7xPOAlew5qUq3UP2gmRMYJi8PtkjFB20/DKeWwWNnkZPqP9AayruRoo51SIiVg870gbZE2jYl+Ncx/FYDe56JeC3ySZsXoAVkC9bP7gkOGqOmJjirvAgPMI7bogVz8i+66Q4Ar7OKTp3762G4IuWPPEg4ce4Y7lx9qWocZapHYq4cYKMxrOZ7SEbFSATBbe2bPZAPKTw8do/Eny+Hq/LkHFhIeyra6cqTFQYShr+zPln0Cr+ro/pDX3bB+1ubFgTpjpkkkQsLhDfR6cCdCWM2lgnS3BTtYj5Ct9/JRPR5YOphqZz+uB+OEu2IL68hmU9vNTth1KeX rlandy@redhat.com" 2026-01-20 16:38:02.745620 | controller | } 2026-01-20 16:38:03.154151 | controller | changed: 2026-01-20 16:38:03.154248 | controller | { 2026-01-20 16:38:03.154277 | controller | "public_key": "ssh-ed25519 AAAAC3NzaC1lZDI1NTE5AAAAIFCbgz8gdERiJlk2IKOtkjQxEXejrio6ZYMJAVJYpOIp raukadah@gmail.com" 2026-01-20 16:38:03.154325 | controller | } 2026-01-20 16:38:03.434992 | controller | changed: 2026-01-20 16:38:03.435146 | controller | { 2026-01-20 16:38:03.435176 | controller | "public_key": "ssh-ed25519 AAAAC3NzaC1lZDI1NTE5AAAAIBqb3Q/9uDf4LmihQ7xeJ9gA/STIQUFPSfyyV0m8AoQi bshewale@redhat.com" 2026-01-20 16:38:03.435198 | controller | } 2026-01-20 16:38:03.768069 | controller | changed: 2026-01-20 16:38:03.768179 | controller | { 2026-01-20 16:38:03.768208 | controller | "public_key": "ssh-rsa AAAAB3NzaC1yc2EAAAADAQABAAABAQC0I8QqQx0Az2ysJt2JuffucLijhBqnsXKEIx5GyHwxVULROa8VtNFXUDH6ZKZavhiMcmfHB2+TBTda+lDP4FldYj06dGmzCY+IYGa+uDRdxHNGYjvCfLFcmLlzRK6fNbTcui+KlUFUdKe0fb9CRoGKyhlJD5GRkM1Dv+Yb6Bj+RNnmm1fVGYxzmrD2utvffYEb0SZGWxq2R9gefx1q/3wCGjeqvufEV+AskPhVGc5T7t9eyZ4qmslkLh1/nMuaIBFcr9AUACRajsvk6mXrAN1g3HlBf2gQlhi1UEyfbqIQvzzFtsbLDlSum/KmKjy818GzvWjERfQ0VkGzCd9bSLVL dviroel@redhat.com" 2026-01-20 16:38:03.768232 | controller | } 2026-01-20 16:38:04.073061 | controller | changed: 2026-01-20 16:38:04.073161 | controller | { 2026-01-20 16:38:04.073189 | controller | "public_key": "ssh-rsa AAAAB3NzaC1yc2EAAAADAQABAAABgQDLOQd4ZLtkZXQGY6UwAr/06ppWQK4fDO3HaqxPk98csyOCBXsliSKK39Bso828+5srIXiW7aI6aC9P5mwi4mUZlGPfJlQbfrcGvY+b/SocuvaGK+1RrHLoJCT52LBhwgrzlXio2jeksZeein8iaTrhsPrOAs7KggIL/rB9hEiB3NaOPWhhoCP4vlW6MEMExGcqB/1FVxXFBPnLkEyW0Lk7ycVflZl2ocRxbfjZi0+tI1Wlinp8PvSQSc/WVrAcDgKjc/mB4ODPOyYy3G8FHgfMsrXSDEyjBKgLKMsdCrAUcqJQWjkqXleXSYOV4q3pzL+9umK+q/e3P/bIoSFQzmJKTU1eDfuvPXmow9F5H54fii/Da7ezlMJ+wPGHJrRAkmzvMbALy7xwswLhZMkOGNtRcPqaKYRmIBKpw3o6bCTtcNUHOtOQnzwY8JzrM2eBWJBXAANYw+9/ho80JIiwhg29CFNpVBuHbql2YxJQNrnl90guN65rYNpDxdIluweyUf8= anbanerj@kaermorhen" 2026-01-20 16:38:04.073213 | controller | } 2026-01-20 16:38:04.376633 | controller | changed: 2026-01-20 16:38:04.376799 | controller | { 2026-01-20 16:38:04.376838 | controller | "public_key": "ssh-rsa AAAAB3NzaC1yc2EAAAADAQABAAABgQC3VwV8Im9kRm49lt3tM36hj4Zv27FxGo4C1Q/0jqhzFmHY7RHbmeRr8ObhwWoHjXSozKWg8FL5ER0z3hTwL0W6lez3sL7hUaCmSuZmG5Hnl3x4vTSxDI9JZ/Y65rtYiiWQo2fC5xJhU/4+0e5e/pseCm8cKRSu+SaxhO+sd6FDojA2x1BzOzKiQRDy/1zWGp/cZkxcEuB1wHI5LMzN03c67vmbu+fhZRAUO4dQkvcnj2LrhQtpa+ytvnSjr8icMDosf1OsbSffwZFyHB/hfWGAfe0eIeSA2XPraxiPknXxiPKx2MJsaUTYbsZcm3EjFdHBBMumw5rBI74zLrMRvCO9GwBEmGT4rFng1nP+yw5DB8sn2zqpOsPg1LYRwCPOUveC13P6pgsZZPh812e8v5EKnETct+5XI3dVpdw6CnNiLwAyVAF15DJvBGT/u1k0Myg/bQn+Gv9k2MSj6LvQmf6WbZu2Wgjm30z3FyCneBqTL7mLF19YXzeC0ufHz5pnO1E= dasm@fedora" 2026-01-20 16:38:04.376863 | controller | } 2026-01-20 16:38:04.698680 | controller | changed: 2026-01-20 16:38:04.698767 | controller | { 2026-01-20 16:38:04.698797 | controller | "public_key": "ssh-ed25519 AAAAC3NzaC1lZDI1NTE5AAAAIHUnwjB20UKmsSed9X73eGNV5AOEFccQ3NYrRW776pEk cjeanner" 2026-01-20 16:38:04.698820 | controller | } 2026-01-20 16:38:05.070436 | controller | changed: 2026-01-20 16:38:05.070527 | controller | { 2026-01-20 16:38:05.070556 | controller | "public_key": "ssh-ed25519 AAAAC3NzaC1lZDI1NTE5AAAAIDercCMGn8rW1C4P67tHgtflPdTeXlpyUJYH+6XDd2lR jgilaber@redhat.com" 2026-01-20 16:38:05.070579 | controller | } 2026-01-20 16:38:05.374187 | controller | changed: 2026-01-20 16:38:05.374423 | controller | { 2026-01-20 16:38:05.374483 | controller | "public_key": "ssh-ed25519 AAAAC3NzaC1lZDI1NTE5AAAAIAMI6kkg9Wg0sG7jIJmyZemEBwUn1yzNpQQd3gnulOmZ adrianfuscoarnejo@gmail.com" 2026-01-20 16:38:05.374509 | controller | } 2026-01-20 16:38:05.709828 | controller | changed: 2026-01-20 16:38:05.709916 | controller | { 2026-01-20 16:38:05.709944 | controller | "public_key": "ecdsa-sha2-nistp256 AAAAE2VjZHNhLXNoYTItbmlzdHAyNTYAAAAIbmlzdHAyNTYAAABBBPijwpQu/3jhhhBZInXNOLEH57DrknPc3PLbsRvYyJIFzwYjX+WD4a7+nGnMYS42MuZk6TJcVqgnqofVx4isoD4= ramishra@redhat.com" 2026-01-20 16:38:05.709966 | controller | } 2026-01-20 16:38:06.044282 | controller | changed: 2026-01-20 16:38:06.044376 | controller | { 2026-01-20 16:38:06.044404 | controller | "public_key": "ssh-ed25519 AAAAC3NzaC1lZDI1NTE5AAAAIGpU/BepK3qX0NRf5Np+dOBDqzQEefhNrw2DCZaH3uWW rebtoor@monolith" 2026-01-20 16:38:06.044426 | controller | } 2026-01-20 16:38:06.373112 | controller | changed: 2026-01-20 16:38:06.373189 | controller | { 2026-01-20 16:38:06.373218 | controller | "public_key": "ssh-ed25519 AAAAC3NzaC1lZDI1NTE5AAAAIDK0iKdi8jQTpQrDdLVH/AAgLVYyTXF7AQ1gjc/5uT3t ykarel@yatinkarel" 2026-01-20 16:38:06.373240 | controller | } 2026-01-20 16:38:06.719378 | controller | changed: 2026-01-20 16:38:06.719466 | controller | { 2026-01-20 16:38:06.719495 | controller | "public_key": "ssh-ed25519 AAAAC3NzaC1lZDI1NTE5AAAAIF/V/cLotA6LZeO32VL45Hd78skuA2lJA425Sm2LlQeZ fmount@horcrux" 2026-01-20 16:38:06.719517 | controller | } 2026-01-20 16:38:07.069062 | controller | changed: 2026-01-20 16:38:07.069163 | controller | { 2026-01-20 16:38:07.069191 | controller | "public_key": "ssh-ed25519 AAAAC3NzaC1lZDI1NTE5AAAAIDa7QCjuDMVmRPo1rREbGwzYeBCYVN+Ou/3WKXZEC6Sr" 2026-01-20 16:38:07.069213 | controller | } 2026-01-20 16:38:07.417536 | controller | changed: 2026-01-20 16:38:07.417623 | controller | { 2026-01-20 16:38:07.417674 | controller | "public_key": "ssh-rsa AAAAB3NzaC1yc2EAAAADAQABAAACAQCfNtF7NvKl915TGsGGoseUb06Hj8L/S4toWf0hExeY+F00woL6NvBlJD0nDct+P5a22I4EhvoQCRQ8reaPCm1lybR3uiRIJsj+8zkVvLwby9LXzfZorlNG9ofjd00FEmB09uW/YvTl6Q9XwwwX6tInzIOv3TMqTHHGOL74ibbj8J/FJR0cFEyj0z4WQRvtkh32xAHl83gbuINryMt0sqRI+clj2381NKL55DRLQrVw0gsfqqxiHAnXg21qWmc4J+b9e9kiuAFQjcjwTVkwJCcg3xbPwC/qokYRby/Y5S40UUd7/jEARGXT7RZgpzTuDd1oZiCVrnrqJNPaMNdVv5MLeFdf1B7iIe5aa/fGouX7AO4SdKhZUdnJmCFAGvjC6S3JMZ2wAcUl+OHnssfmdj7XL50cLo27vjuzMtLAgSqi6N99m92WCF2s8J9aVzszX7Xz9OKZCeGsiVJp3/NdABKzSEAyM9xBD/5Vho894Sav+otpySHe3p6RUTgbB5Zu8VyZRZ/UtB3ueXxyo764yrc6qWIDqrehm84Xm9g+/jpIBzGPl07NUNJpdt/6Sgf9RIKXw/7XypO5yZfUcuFNGTxLfqjTNrtgLZNcjfav6sSdVXVcMPL//XNuRdKmVFaO76eV/oGMQGr1fGcCD+N+CpI7+Q+fCNB6VFWG4nZFuI/Iuw== averdagu@redhat.com" 2026-01-20 16:38:07.417708 | controller | } 2026-01-20 16:38:07.754582 | controller | changed: 2026-01-20 16:38:07.754674 | controller | { 2026-01-20 16:38:07.754702 | controller | "public_key": "ssh-rsa AAAAB3NzaC1yc2EAAAADAQABAAABgQDq8l27xI+QlQVdS4djp9ogSoyrNE2+Ox6vKPdhSNL1J3PE5w+WCSvMz9A5gnNuH810zwbekEApbxTze/gLQJwBHA52CChfURpXrFaxY7ePXRElwKAL3mJfzBWY/c5jnNL9TCVmFJTGZkFZP3Nh+BMgZvL6xBkt3WKm6Uq18qzd9XeKcZusrA+O+uLv1fVeQnadY9RIqOCyeFYCzLWrUfTyE8x/XG0hAWIM7qpnF2cALQS2h9n4hW5ybiUN790H08wf9hFwEf5nxY9Z9dVkPFQiTSGKNBzmnCXU9skxS/xhpFjJ5duGSZdtAHe9O+nGZm9c67hxgtf8e5PDuqAdXEv2cf6e3VBAt+Bz8EKI3yosTj0oZHfwr42Yzb1l/SKy14Rggsrc9KAQlrGXan6+u2jcQqqx7l+SWmnpFiWTV9u5cWj2IgOhApOitmRBPYqk9rE2usfO0hLn/Pj/R/Nau4803e1/EikdLE7Ps95s9mX5jRDjAoUa2JwFF5RsVFyL910= ashigupt@ashigupt.remote.csb" 2026-01-20 16:38:07.754725 | controller | } 2026-01-20 16:38:08.085764 | controller | changed: 2026-01-20 16:38:08.085928 | controller | { 2026-01-20 16:38:08.085965 | controller | "public_key": "ssh-ed25519 AAAAC3NzaC1lZDI1NTE5AAAAIOKLl0NYKwoZ/JY5KeZU8VwRAggeOxqQJeoqp3dsAaY9" 2026-01-20 16:38:08.085988 | controller | } 2026-01-20 16:38:08.398186 | controller | changed: 2026-01-20 16:38:08.398275 | controller | { 2026-01-20 16:38:08.398341 | controller | "public_key": "ssh-ed25519 AAAAC3NzaC1lZDI1NTE5AAAAIASASQOH2BcOyLKuuDOdWZlPi2orcjcA8q4400T73DLH evallesp@fedora" 2026-01-20 16:38:08.398369 | controller | } 2026-01-20 16:38:08.705659 | controller | changed: 2026-01-20 16:38:08.705748 | controller | { 2026-01-20 16:38:08.705777 | controller | "public_key": "ssh-ed25519 AAAAC3NzaC1lZDI1NTE5AAAAILeBWlamUph+jRKV2qrx1PGU7vWuGIt5+z9k96I8WehW amsinha@amsinha-mac" 2026-01-20 16:38:08.705799 | controller | } 2026-01-20 16:38:09.081466 | controller | changed: 2026-01-20 16:38:09.081544 | controller | { 2026-01-20 16:38:09.081572 | controller | "public_key": "ssh-ed25519 AAAAC3NzaC1lZDI1NTE5AAAAIANvVgvJBlK3gb1yz5uef/JqIGq4HLEmY2dYA8e37swb morenod@redhat-laptop" 2026-01-20 16:38:09.081594 | controller | } 2026-01-20 16:38:09.397987 | controller | changed: 2026-01-20 16:38:09.398069 | controller | { 2026-01-20 16:38:09.398109 | controller | "public_key": "ssh-rsa AAAAB3NzaC1yc2EAAAADAQABAAACAQDZdI7t1cxYx65heVI24HTV4F7oQLW1zyfxHreL2TIJKxjyrUUKIFEUmTutcBlJRLNT2Eoix6x1sOw9YrchloCLcn//SGfTElr9mSc5jbjb7QXEU+zJMhtxyEJ1Po3CUGnj7ckiIXw7wcawZtrEOAQ9pH3ExYCJcEMiyNjRQZCxT3tPK+S4B95EWh5Fsrz9CkwpjNRPPH7LigCeQTM3Wc7r97utAslBUUvYceDSLA7rMgkitJE38b7rZBeYzsGQ8YYUBjTCtehqQXxCRjizbHWaaZkBU+N3zkKB6n/iCNGIO690NK7A/qb6msTijiz1PeuM8ThOsi9qXnbX5v0PoTpcFSojV7NHAQ71f0XXuS43FhZctT+Dcx44dT8Fb5vJu2cJGrk+qF8ZgJYNpRS7gPg0EG2EqjK7JMf9ULdjSu0r+KlqIAyLvtzT4eOnQipoKlb/WG5D/0ohKv7OMQ352ggfkBFIQsRXyyTCT98Ft9juqPuahi3CAQmP4H9dyE+7+Kz437PEtsxLmfm6naNmWi7Ee1DqWPwS8rEajsm4sNM4wW9gdBboJQtc0uZw0DfLj1I9r3Mc8Ol0jYtz0yNQDSzVLrGCaJlC311trU70tZ+ZkAVV6Mn8lOhSbj1cK0lvSr6ZK4dgqGl3I1eTZJJhbLNdg7UOVaiRx9543+C/p/As7w== brjackma@redhat.com" 2026-01-20 16:38:09.398133 | controller | } 2026-01-20 16:38:09.745412 | controller | changed: 2026-01-20 16:38:09.745486 | controller | { 2026-01-20 16:38:09.745513 | controller | "public_key": "ssh-ed25519 AAAAC3NzaC1lZDI1NTE5AAAAIKwedoZ0TWPJX/z/4TAbO/kKcDZOQVgRH0hAqrL5UCI1 vcastell@redhat.com" 2026-01-20 16:38:09.745534 | controller | } 2026-01-20 16:38:10.105189 | controller | changed: 2026-01-20 16:38:10.105268 | controller | { 2026-01-20 16:38:10.105311 | controller | "public_key": "ssh-ed25519 AAAAC3NzaC1lZDI1NTE5AAAAIEmv8sE8GCk6ZTPIqF0FQrttBdL3mq7rCm/IJy0xDFh7 michburk@redhat.com" 2026-01-20 16:38:10.105340 | controller | } 2026-01-20 16:38:10.414761 | controller | changed: 2026-01-20 16:38:10.414837 | controller | { 2026-01-20 16:38:10.414865 | controller | "public_key": "ssh-ed25519 AAAAC3NzaC1lZDI1NTE5AAAAICy6GpGEtwevXEEn4mmLR5lmSLe23dGgAvzkB9DMNbkf rsafrono@rsafrono" 2026-01-20 16:38:10.414886 | controller | } 2026-01-20 16:38:10.463068 | 2026-01-20 16:38:10.463489 | TASK [Set timezone to UTC] 2026-01-20 16:38:11.668449 | controller | changed: executed `/bin/timedatectl set-timezone UTC` 2026-01-20 16:38:11.677403 | 2026-01-20 16:38:11.677474 | TASK [Create nodepool directory] 2026-01-20 16:38:12.041844 | controller | changed 2026-01-20 16:38:12.052159 | 2026-01-20 16:38:12.052241 | TASK [Create nodepool sub_nodes file] 2026-01-20 16:38:13.406586 | controller | changed 2026-01-20 16:38:13.419772 | 2026-01-20 16:38:13.419847 | TASK [Create nodepool sub_nodes_private file] 2026-01-20 16:38:14.820466 | controller | changed 2026-01-20 16:38:14.826489 | 2026-01-20 16:38:14.826551 | LOOP [Populate nodepool sub_nodes file] 2026-01-20 16:38:14.908600 | 2026-01-20 16:38:14.908745 | LOOP [Populate nodepool sub_nodes_private file] 2026-01-20 16:38:14.938966 | 2026-01-20 16:38:14.939106 | TASK [Create nodepool primary file] 2026-01-20 16:38:15.044681 | controller | skipping: Conditional result was False 2026-01-20 16:38:15.053997 | 2026-01-20 16:38:15.054094 | TASK [Create nodepool node_private for this node] 2026-01-20 16:38:16.462007 | controller | changed 2026-01-20 16:38:16.481041 | 2026-01-20 16:38:16.481135 | LOOP [Copy ssh keys to nodepool directory] 2026-01-20 16:38:17.592288 | controller | ok: Item: id_rsa Runtime: 0:00:00.004254 2026-01-20 16:38:17.592473 | 2026-01-20 16:38:17.844235 | controller | ok: Item: id_rsa.pub Runtime: 0:00:00.005663 2026-01-20 16:38:17.855133 | 2026-01-20 16:38:17.855239 | TASK [Add sudoers role for zuul-sudo-grep.sh] 2026-01-20 16:38:19.264714 | controller | changed 2026-01-20 16:38:19.277614 | 2026-01-20 16:38:19.277695 | TASK [Validate sudoers config after edits] 2026-01-20 16:38:19.863880 | controller | /etc/sudoers: parsed OK 2026-01-20 16:38:19.863947 | controller | /etc/sudoers.d/90-cloud-init-users: parsed OK 2026-01-20 16:38:19.863956 | controller | /etc/sudoers.d/zuul: parsed OK 2026-01-20 16:38:19.863962 | controller | /etc/sudoers.d/zuul-sudo-grep: parsed OK 2026-01-20 16:38:19.908739 | controller | ok: Runtime: 0:00:00.005385 2026-01-20 16:38:19.920873 | 2026-01-20 16:38:19.920942 | TASK [Show the environment passed in to job shell scripts] 2026-01-20 16:38:20.757166 | controller | SHELL=/bin/bash 2026-01-20 16:38:20.757237 | controller | ZUUL_PROJECT=openstack-k8s-operators/ci-framework 2026-01-20 16:38:20.757259 | controller | ZUUL_SHORT_PROJECT_NAME=ci-framework 2026-01-20 16:38:20.757323 | controller | ZUUL_CHANGES=rdo-jobs:master:refs/changes/88/58488/2^openstack-k8s-operators/ci-framework:main:refs/changes/51/3451/3b80a23c9439dd2e7554486894e6cc29bcabd667 2026-01-20 16:38:20.757337 | controller | PWD=/home/zuul 2026-01-20 16:38:20.757342 | controller | ZUUL_PIPELINE=github-check 2026-01-20 16:38:20.757348 | controller | LOGNAME=zuul 2026-01-20 16:38:20.757354 | controller | XDG_SESSION_TYPE=tty 2026-01-20 16:38:20.757359 | controller | _=/usr/bin/env 2026-01-20 16:38:20.757364 | controller | MOTD_SHOWN=pam 2026-01-20 16:38:20.757370 | controller | HOME=/home/zuul 2026-01-20 16:38:20.757375 | controller | LANG=en_US.UTF-8 2026-01-20 16:38:20.757389 | controller | SSH_CONNECTION=192.168.26.12 35126 192.168.26.140 22 2026-01-20 16:38:20.757395 | controller | TOX_TESTENV_PASSENV=ZUUL_UUID ZUUL_PROJECT ZUUL_SHORT_PROJECT_NAME ZUUL_PIPELINE ZUUL_VOTING WORKSPACE BUILD_TIMEOUT ZUUL_BRANCH ZUUL_CHANGES ZUUL_CHANGE_IDS ZUUL_CHANGE ZUUL_PATCHSET 2026-01-20 16:38:20.757403 | controller | ZUUL_CHANGE_IDS=58488,2 3451,3b80a23c9439dd2e7554486894e6cc29bcabd667 2026-01-20 16:38:20.757408 | controller | WORKSPACE=/home/zuul/workspace 2026-01-20 16:38:20.757414 | controller | XDG_SESSION_CLASS=user 2026-01-20 16:38:20.757420 | controller | SELINUX_ROLE_REQUESTED= 2026-01-20 16:38:20.757425 | controller | LESSOPEN=||/usr/bin/lesspipe.sh %s 2026-01-20 16:38:20.757430 | controller | USER=zuul 2026-01-20 16:38:20.757436 | controller | ZUUL_VOTING=True 2026-01-20 16:38:20.757441 | controller | BUILD_TIMEOUT=1800000 2026-01-20 16:38:20.757446 | controller | SELINUX_USE_CURRENT_RANGE= 2026-01-20 16:38:20.757451 | controller | SHLVL=1 2026-01-20 16:38:20.757457 | controller | ZUUL_PATCHSET=3b80a23c9439dd2e7554486894e6cc29bcabd667 2026-01-20 16:38:20.757462 | controller | XDG_SESSION_ID=1 2026-01-20 16:38:20.757468 | controller | ZUUL_BRANCH=main 2026-01-20 16:38:20.757473 | controller | XDG_RUNTIME_DIR=/run/user/1000 2026-01-20 16:38:20.757479 | controller | SSH_CLIENT=192.168.26.12 35126 22 2026-01-20 16:38:20.757484 | controller | DEBUGINFOD_URLS=https://debuginfod.centos.org/ 2026-01-20 16:38:20.757489 | controller | DEBUGINFOD_IMA_CERT_PATH=/etc/keys/ima: 2026-01-20 16:38:20.757495 | controller | which_declare=declare -f 2026-01-20 16:38:20.757501 | controller | PATH=/home/zuul/.crc/bin/oc:/home/zuul/.local/bin:/home/zuul/bin:/usr/local/bin:/usr/bin:/usr/local/sbin:/usr/sbin 2026-01-20 16:38:20.757506 | controller | SELINUX_LEVEL_REQUESTED= 2026-01-20 16:38:20.757511 | controller | ZUUL_CHANGE=3451 2026-01-20 16:38:20.757517 | controller | DBUS_SESSION_BUS_ADDRESS=unix:path=/run/user/1000/bus 2026-01-20 16:38:20.757522 | controller | ZUUL_UUID=559949fc17d34b658e1f4a2b497a9a66 2026-01-20 16:38:20.757527 | controller | BASH_FUNC_which%%=() { ( alias; 2026-01-20 16:38:20.757532 | controller | eval ${which_declare} ) | /usr/bin/which --tty-only --read-alias --read-functions --show-tilde --show-dot $@ 2026-01-20 16:38:20.757538 | controller | } 2026-01-20 16:38:21.053702 | controller | ok: Runtime: 0:00:00.006291 2026-01-20 16:38:21.059336 | 2026-01-20 16:38:21.059398 | TASK [Workaround hardcoded /home/zuul/workspace in zuul_legacy_vars] 2026-01-20 16:38:21.143645 | controller | skipping: Conditional result was False 2026-01-20 16:38:21.149634 | 2026-01-20 16:38:21.149709 | TASK [Symlink /home/zuul-worker/workspace] 2026-01-20 16:38:21.782368 | controller | skipping: Conditional result was False 2026-01-20 16:38:21.789961 | 2026-01-20 16:38:21.790236 | TASK [Ensure legacy workspace directory] 2026-01-20 16:38:22.205616 | controller | changed 2026-01-20 16:38:22.326495 | 2026-01-20 16:38:22.326611 | PLAY RECAP 2026-01-20 16:38:22.326667 | controller | ok: 14 changed: 11 unreachable: 0 failed: 0 skipped: 5 rescued: 0 ignored: 0 2026-01-20 16:38:22.326692 | 2026-01-20 16:38:22.754422 | PRE-RUN END RESULT_NORMAL: [trusted : review.rdoproject.org/config/playbooks/ci-framework-rdo-base/pre.yaml@master] 2026-01-20 16:38:22.755143 | PRE-RUN START: [trusted : review.rdoproject.org/config/playbooks/crc/podman.yaml@master] 2026-01-20 16:38:25.282549 | 2026-01-20 16:38:25.282647 | PLAY [all,!compute] 2026-01-20 16:38:25.376128 | 2026-01-20 16:38:25.376251 | TASK [Enable container-tools rhel-modules for c8/crc node] 2026-01-20 16:38:25.952984 | controller | skipping: Conditional result was False 2026-01-20 16:38:25.959097 | 2026-01-20 16:38:25.959181 | TASK [Install podman] 2026-01-20 16:38:26.117668 | controller | skipping: Conditional result was False 2026-01-20 16:38:26.125733 | 2026-01-20 16:38:26.125802 | TASK [Set var name for quay login zuul secret] 2026-01-20 16:38:26.264472 | controller | skipping: Conditional result was False 2026-01-20 16:38:26.270684 | 2026-01-20 16:38:26.270767 | TASK [Print the username] 2026-01-20 16:38:26.865105 | controller | skipping: Conditional result was False 2026-01-20 16:38:26.871403 | 2026-01-20 16:38:26.871493 | TASK [Fail when user or password is not set] 2026-01-20 16:38:27.057622 | controller | skipping: Conditional result was False 2026-01-20 16:38:27.064343 | 2026-01-20 16:38:27.064519 | TASK [Set vars for quay login] 2026-01-20 16:38:27.211496 | 2026-01-20 16:38:27.211637 | LOOP [Perform container registry login(s) with podman] 2026-01-20 16:38:27.360974 | 2026-01-20 16:38:27.361134 | LOOP [Perform container registry login(s) with buildah] 2026-01-20 16:38:27.624957 | 2026-01-20 16:38:27.625110 | TASK [Set Insecure registry for content provider] 2026-01-20 16:38:27.740150 | controller | skipping: Conditional result was False 2026-01-20 16:38:27.793674 | 2026-01-20 16:38:27.793741 | PLAY RECAP 2026-01-20 16:38:27.793784 | controller | ok: 0 changed: 0 unreachable: 0 failed: 0 skipped: 9 rescued: 0 ignored: 0 2026-01-20 16:38:27.793808 | 2026-01-20 16:38:28.282912 | PRE-RUN END RESULT_NORMAL: [trusted : review.rdoproject.org/config/playbooks/crc/podman.yaml@master] 2026-01-20 16:38:28.283675 | PRE-RUN START: [trusted : review.rdoproject.org/config/playbooks/crc/simple-start.yaml@master] 2026-01-20 16:38:31.225365 | 2026-01-20 16:38:31.225489 | PLAY [Prefer ipv4 over ipv6] 2026-01-20 16:38:31.316801 | 2026-01-20 16:38:31.316943 | TASK [Configure /etc/gai.conf to prever ipv4 over ipv6] 2026-01-20 16:38:31.520417 | controller | skipping: Conditional result was False 2026-01-20 16:38:31.593462 | 2026-01-20 16:38:31.593560 | PLAY [controller] 2026-01-20 16:38:31.654983 | 2026-01-20 16:38:31.655094 | TASK [Fail when openshift_pull_sec not provided] 2026-01-20 16:38:31.784528 | controller | skipping: Conditional result was False 2026-01-20 16:38:31.791322 | 2026-01-20 16:38:31.791406 | TASK [Clone repos in the job workspace] 2026-01-20 16:38:31.826807 | controller | ok 2026-01-20 16:38:31.847441 | 2026-01-20 16:38:31.847520 | TASK [prepare-workspace : Start zuul_console daemon.] 2026-01-20 16:38:32.682985 | controller | ok 2026-01-20 16:38:32.697437 | 2026-01-20 16:38:32.697511 | TASK [prepare-workspace : Synchronize src repos to workspace directory.] 2026-01-20 16:38:47.844316 | controller | Output suppressed because no_log was given 2026-01-20 16:38:47.880636 | 2026-01-20 16:38:47.880750 | TASK [Create pull-secret.txt file] 2026-01-20 16:38:50.425776 | controller | Output suppressed because no_log was given 2026-01-20 16:38:50.430888 | 2026-01-20 16:38:50.430964 | TASK [Apply CRC features and print image build date] 2026-01-20 16:38:50.503564 | controller | ok 2026-01-20 16:38:50.526617 | controller | included: /var/lib/zuul/builds/559949fc17d34b658e1f4a2b497a9a66/trusted/project_0/review.rdoproject.org/config/playbooks/crc/features.yaml 2026-01-20 16:38:50.576059 | 2026-01-20 16:38:50.576181 | TASK [Set additional parameters for crc - telemetry] 2026-01-20 16:38:51.234560 | controller | skipping: Conditional result was False 2026-01-20 16:38:51.242250 | 2026-01-20 16:38:51.243421 | TASK [Set additional parameters for crc - monitoring] 2026-01-20 16:38:51.815831 | controller | skipping: Conditional result was False 2026-01-20 16:38:51.838982 | 2026-01-20 16:38:51.839157 | TASK [Set minimum required memory to run the CRC when monitoring enabled] 2026-01-20 16:38:52.486228 | controller | skipping: Conditional result was False 2026-01-20 16:38:52.491673 | 2026-01-20 16:38:52.491740 | TASK [Set additional parameters for crc - enable microshift preset] 2026-01-20 16:38:53.122113 | controller | skipping: Conditional result was False 2026-01-20 16:38:53.128217 | 2026-01-20 16:38:53.128287 | TASK [Set additional parameters for crc - enable okd preset] 2026-01-20 16:38:53.788241 | controller | skipping: Conditional result was False 2026-01-20 16:38:53.794959 | 2026-01-20 16:38:53.795040 | TASK [Delete the cluster if there's a non-default bundle URL] 2026-01-20 16:38:54.393889 | controller | skipping: Conditional result was False 2026-01-20 16:38:54.399177 | 2026-01-20 16:38:54.399242 | TASK [Execute crc start command] 2026-01-20 16:41:45.786492 | controller | ok: Runtime: 0:02:50.433532 2026-01-20 16:41:45.791730 | 2026-01-20 16:41:45.791792 | TASK [Verify that OpenShift is up and running] 2026-01-20 16:41:45.810067 | controller | ok 2026-01-20 16:41:45.818925 | controller | included: /var/lib/zuul/builds/559949fc17d34b658e1f4a2b497a9a66/trusted/project_0/review.rdoproject.org/config/playbooks/crc/verify_openshift_start.yaml 2026-01-20 16:41:45.825916 | 2026-01-20 16:41:45.825980 | TASK [Create script to login and verify services] 2026-01-20 16:41:46.890846 | controller | changed 2026-01-20 16:41:46.896472 | 2026-01-20 16:41:46.896556 | TASK [Ensure that user is logged] 2026-01-20 16:41:47.175392 | controller | Checking login to the cluster 1... 2026-01-20 16:41:47.622279 | controller | WARNING: Using insecure TLS client config. Setting this option is not supported! 2026-01-20 16:41:47.656768 | controller | 2026-01-20 16:41:47.656820 | controller | The connection to the server oauth-openshift.apps-crc.testing was refused - did you specify the right host or port? 2026-01-20 16:41:47.660600 | controller | Can not login to the CRC cluster. Sleeping... 2026-01-20 16:41:52.662855 | controller | Checking login to the cluster 2... 2026-01-20 16:41:52.756039 | controller | WARNING: Using insecure TLS client config. Setting this option is not supported! 2026-01-20 16:41:52.771992 | controller | 2026-01-20 16:41:52.772042 | controller | The connection to the server oauth-openshift.apps-crc.testing was refused - did you specify the right host or port? 2026-01-20 16:41:52.776032 | controller | Can not login to the CRC cluster. Sleeping... 2026-01-20 16:41:57.777916 | controller | Checking login to the cluster 3... 2026-01-20 16:41:57.864171 | controller | WARNING: Using insecure TLS client config. Setting this option is not supported! 2026-01-20 16:41:57.877202 | controller | 2026-01-20 16:41:57.877276 | controller | The connection to the server oauth-openshift.apps-crc.testing was refused - did you specify the right host or port? 2026-01-20 16:41:57.881254 | controller | Can not login to the CRC cluster. Sleeping... 2026-01-20 16:42:02.882758 | controller | Checking login to the cluster 4... 2026-01-20 16:42:02.974479 | controller | WARNING: Using insecure TLS client config. Setting this option is not supported! 2026-01-20 16:42:02.991430 | controller | 2026-01-20 16:42:02.991476 | controller | The connection to the server oauth-openshift.apps-crc.testing was refused - did you specify the right host or port? 2026-01-20 16:42:02.995731 | controller | Can not login to the CRC cluster. Sleeping... 2026-01-20 16:42:07.997675 | controller | Checking login to the cluster 5... 2026-01-20 16:42:08.082131 | controller | WARNING: Using insecure TLS client config. Setting this option is not supported! 2026-01-20 16:42:08.099259 | controller | 2026-01-20 16:42:08.099311 | controller | The connection to the server oauth-openshift.apps-crc.testing was refused - did you specify the right host or port? 2026-01-20 16:42:08.102646 | controller | Can not login to the CRC cluster. Sleeping... 2026-01-20 16:42:13.104762 | controller | Checking login to the cluster 6... 2026-01-20 16:42:13.190061 | controller | WARNING: Using insecure TLS client config. Setting this option is not supported! 2026-01-20 16:42:13.201745 | controller | 2026-01-20 16:42:13.201839 | controller | The connection to the server oauth-openshift.apps-crc.testing was refused - did you specify the right host or port? 2026-01-20 16:42:13.206000 | controller | Can not login to the CRC cluster. Sleeping... 2026-01-20 16:42:18.207735 | controller | Checking login to the cluster 7... 2026-01-20 16:42:18.292098 | controller | WARNING: Using insecure TLS client config. Setting this option is not supported! 2026-01-20 16:42:18.307206 | controller | 2026-01-20 16:42:18.307264 | controller | The connection to the server oauth-openshift.apps-crc.testing was refused - did you specify the right host or port? 2026-01-20 16:42:18.310888 | controller | Can not login to the CRC cluster. Sleeping... 2026-01-20 16:42:23.312636 | controller | Checking login to the cluster 8... 2026-01-20 16:42:23.403938 | controller | WARNING: Using insecure TLS client config. Setting this option is not supported! 2026-01-20 16:42:23.422351 | controller | 2026-01-20 16:42:23.422393 | controller | The connection to the server oauth-openshift.apps-crc.testing was refused - did you specify the right host or port? 2026-01-20 16:42:23.426292 | controller | Can not login to the CRC cluster. Sleeping... 2026-01-20 16:42:28.427922 | controller | Checking login to the cluster 9... 2026-01-20 16:42:28.520034 | controller | WARNING: Using insecure TLS client config. Setting this option is not supported! 2026-01-20 16:42:28.539514 | controller | 2026-01-20 16:42:28.539571 | controller | The connection to the server oauth-openshift.apps-crc.testing was refused - did you specify the right host or port? 2026-01-20 16:42:28.543327 | controller | Can not login to the CRC cluster. Sleeping... 2026-01-20 16:42:33.546008 | controller | Checking login to the cluster 10... 2026-01-20 16:42:33.629016 | controller | WARNING: Using insecure TLS client config. Setting this option is not supported! 2026-01-20 16:42:33.643297 | controller | 2026-01-20 16:42:33.643343 | controller | The connection to the server oauth-openshift.apps-crc.testing was refused - did you specify the right host or port? 2026-01-20 16:42:33.647287 | controller | Can not login to the CRC cluster. Sleeping... 2026-01-20 16:42:38.649095 | controller | Checking login to the cluster 11... 2026-01-20 16:42:38.741374 | controller | WARNING: Using insecure TLS client config. Setting this option is not supported! 2026-01-20 16:42:38.754638 | controller | 2026-01-20 16:42:38.754686 | controller | The connection to the server oauth-openshift.apps-crc.testing was refused - did you specify the right host or port? 2026-01-20 16:42:38.758546 | controller | Can not login to the CRC cluster. Sleeping... 2026-01-20 16:42:43.760269 | controller | Checking login to the cluster 12... 2026-01-20 16:42:43.845124 | controller | WARNING: Using insecure TLS client config. Setting this option is not supported! 2026-01-20 16:42:43.881283 | controller | 2026-01-20 16:42:43.881324 | controller | Error from server (InternalError): Internal error occurred: unexpected response: 503 2026-01-20 16:42:43.885203 | controller | Can not login to the CRC cluster. Sleeping... 2026-01-20 16:42:48.887095 | controller | Checking login to the cluster 13... 2026-01-20 16:42:48.971500 | controller | WARNING: Using insecure TLS client config. Setting this option is not supported! 2026-01-20 16:42:49.005263 | controller | 2026-01-20 16:42:49.005322 | controller | Error from server (InternalError): Internal error occurred: unexpected response: 503 2026-01-20 16:42:49.010021 | controller | Can not login to the CRC cluster. Sleeping... 2026-01-20 16:42:54.012564 | controller | Checking login to the cluster 14... 2026-01-20 16:42:54.107011 | controller | WARNING: Using insecure TLS client config. Setting this option is not supported! 2026-01-20 16:42:54.139253 | controller | 2026-01-20 16:42:54.139306 | controller | Error from server (InternalError): Internal error occurred: unexpected response: 503 2026-01-20 16:42:54.142968 | controller | Can not login to the CRC cluster. Sleeping... 2026-01-20 16:42:59.144708 | controller | Checking login to the cluster 15... 2026-01-20 16:42:59.241381 | controller | WARNING: Using insecure TLS client config. Setting this option is not supported! 2026-01-20 16:42:59.276908 | controller | 2026-01-20 16:42:59.276979 | controller | Error from server (InternalError): Internal error occurred: unexpected response: 503 2026-01-20 16:42:59.280769 | controller | Can not login to the CRC cluster. Sleeping... 2026-01-20 16:43:04.283002 | controller | Checking login to the cluster 16... 2026-01-20 16:43:04.368316 | controller | WARNING: Using insecure TLS client config. Setting this option is not supported! 2026-01-20 16:43:04.410009 | controller | 2026-01-20 16:43:04.410062 | controller | Error from server (InternalError): Internal error occurred: unexpected response: 503 2026-01-20 16:43:04.413513 | controller | Can not login to the CRC cluster. Sleeping... 2026-01-20 16:43:09.415459 | controller | Checking login to the cluster 17... 2026-01-20 16:43:09.604935 | controller | WARNING: Using insecure TLS client config. Setting this option is not supported! 2026-01-20 16:43:09.885320 | controller | 2026-01-20 16:43:09.885479 | controller | Error from server (InternalError): Internal error occurred: unexpected response: 503 2026-01-20 16:43:09.889958 | controller | Can not login to the CRC cluster. Sleeping... 2026-01-20 16:43:14.892596 | controller | Checking login to the cluster 18... 2026-01-20 16:43:15.002491 | controller | WARNING: Using insecure TLS client config. Setting this option is not supported! 2026-01-20 16:43:15.100473 | controller | 2026-01-20 16:43:15.100527 | controller | Error from server (InternalError): Internal error occurred: unexpected response: 503 2026-01-20 16:43:15.104297 | controller | Can not login to the CRC cluster. Sleeping... 2026-01-20 16:43:20.107352 | controller | Checking login to the cluster 19... 2026-01-20 16:43:20.229034 | controller | WARNING: Using insecure TLS client config. Setting this option is not supported! 2026-01-20 16:43:20.327233 | controller | 2026-01-20 16:43:20.327300 | controller | Error from server (InternalError): Internal error occurred: unexpected response: 503 2026-01-20 16:43:20.331104 | controller | Can not login to the CRC cluster. Sleeping... 2026-01-20 16:43:25.336693 | controller | Checking login to the cluster 20... 2026-01-20 16:43:25.435000 | controller | WARNING: Using insecure TLS client config. Setting this option is not supported! 2026-01-20 16:43:25.500971 | controller | 2026-01-20 16:43:25.501026 | controller | Error from server (InternalError): Internal error occurred: unexpected response: 503 2026-01-20 16:43:25.510324 | controller | Can not login to the CRC cluster. Sleeping... 2026-01-20 16:43:30.515005 | controller | Checking login to the cluster 21... 2026-01-20 16:43:30.666897 | controller | WARNING: Using insecure TLS client config. Setting this option is not supported! 2026-01-20 16:43:30.724003 | controller | 2026-01-20 16:43:30.724059 | controller | The connection to the server oauth-openshift.apps-crc.testing was refused - did you specify the right host or port? 2026-01-20 16:43:30.728020 | controller | Can not login to the CRC cluster. Sleeping... 2026-01-20 16:43:35.731770 | controller | Checking login to the cluster 22... 2026-01-20 16:43:35.943626 | controller | WARNING: Using insecure TLS client config. Setting this option is not supported! 2026-01-20 16:43:37.243311 | controller | 2026-01-20 16:43:37.243377 | controller | The connection to the server oauth-openshift.apps-crc.testing was refused - did you specify the right host or port? 2026-01-20 16:43:37.247290 | controller | Can not login to the CRC cluster. Sleeping... 2026-01-20 16:43:42.249069 | controller | Checking login to the cluster 23... 2026-01-20 16:43:43.168096 | controller | WARNING: Using insecure TLS client config. Setting this option is not supported! 2026-01-20 16:43:43.294779 | controller | 2026-01-20 16:43:43.294867 | controller | The connection to the server oauth-openshift.apps-crc.testing was refused - did you specify the right host or port? 2026-01-20 16:43:43.299266 | controller | Can not login to the CRC cluster. Sleeping... 2026-01-20 16:43:48.301816 | controller | Checking login to the cluster 24... 2026-01-20 16:43:48.919813 | controller | WARNING: Using insecure TLS client config. Setting this option is not supported! 2026-01-20 16:43:49.531605 | controller | 2026-01-20 16:43:49.531669 | controller | The connection to the server oauth-openshift.apps-crc.testing was refused - did you specify the right host or port? 2026-01-20 16:43:49.535674 | controller | Can not login to the CRC cluster. Sleeping... 2026-01-20 16:43:54.538129 | controller | Checking login to the cluster 25... 2026-01-20 16:43:54.704884 | controller | WARNING: Using insecure TLS client config. Setting this option is not supported! 2026-01-20 16:43:54.847530 | controller | 2026-01-20 16:43:54.847653 | controller | The connection to the server oauth-openshift.apps-crc.testing was refused - did you specify the right host or port? 2026-01-20 16:43:54.851712 | controller | Can not login to the CRC cluster. Sleeping... 2026-01-20 16:43:59.853716 | controller | Checking login to the cluster 26... 2026-01-20 16:43:59.991708 | controller | WARNING: Using insecure TLS client config. Setting this option is not supported! 2026-01-20 16:44:00.026843 | controller | 2026-01-20 16:44:00.026901 | controller | The connection to the server oauth-openshift.apps-crc.testing was refused - did you specify the right host or port? 2026-01-20 16:44:00.031065 | controller | Can not login to the CRC cluster. Sleeping... 2026-01-20 16:44:05.033437 | controller | Checking login to the cluster 27... 2026-01-20 16:44:05.163468 | controller | WARNING: Using insecure TLS client config. Setting this option is not supported! 2026-01-20 16:44:05.234688 | controller | 2026-01-20 16:44:05.234750 | controller | Unable to connect to the server: EOF 2026-01-20 16:44:05.238472 | controller | Can not login to the CRC cluster. Sleeping... 2026-01-20 16:44:10.243522 | controller | Checking login to the cluster 28... 2026-01-20 16:44:10.398710 | controller | WARNING: Using insecure TLS client config. Setting this option is not supported! 2026-01-20 16:44:12.886871 | controller | 2026-01-20 16:44:12.886940 | controller | Login successful. 2026-01-20 16:44:12.991910 | controller | 2026-01-20 16:44:12.991964 | controller | You have access to 65 projects, the list has been suppressed. You can list all projects with 'oc projects' 2026-01-20 16:44:12.991991 | controller | 2026-01-20 16:44:12.992000 | controller | Using project "default". 2026-01-20 16:44:13.096496 | controller | changed 2026-01-20 16:44:13.102463 | 2026-01-20 16:44:13.102545 | TASK [Delete all openshift-marketplace pods] 2026-01-20 16:44:15.853446 | controller | pod "certified-operators-bh7xw" deleted 2026-01-20 16:44:16.418500 | controller | pod "certified-operators-f8szs" deleted 2026-01-20 16:44:18.976120 | controller | pod "community-operators-5zsqg" deleted 2026-01-20 16:44:19.466281 | controller | pod "community-operators-dlsrd" deleted 2026-01-20 16:44:19.562873 | controller | pod "marketplace-operator-79b997595-d2lpl" deleted 2026-01-20 16:44:19.748654 | controller | pod "redhat-marketplace-gh6vd" deleted 2026-01-20 16:44:19.822914 | controller | pod "redhat-marketplace-ps6xk" deleted 2026-01-20 16:44:19.901899 | controller | pod "redhat-operators-gffnm" deleted 2026-01-20 16:44:20.008858 | controller | pod "redhat-operators-tqxl9" deleted 2026-01-20 16:45:43.259822 | controller | ok 2026-01-20 16:45:43.265780 | 2026-01-20 16:45:43.265858 | TASK [Copy script ensure_services_up.sh] 2026-01-20 16:45:43.299749 | controller | skipping: Conditional result was False 2026-01-20 16:45:43.305048 | 2026-01-20 16:45:43.305139 | TASK [Ensure all pods are up and running] 2026-01-20 16:45:43.831444 | controller | skipping: Conditional result was False 2026-01-20 16:45:43.837524 | 2026-01-20 16:45:43.837613 | TASK [Check if there is a image build date file] 2026-01-20 16:45:44.283143 | controller | ok 2026-01-20 16:45:44.289006 | 2026-01-20 16:45:44.289085 | TASK [Print image date if available] 2026-01-20 16:45:44.641757 | controller | Tue Apr 1 06:17:46 PM EDT 2025 2026-01-20 16:45:44.838573 | controller | changed 2026-01-20 16:45:44.844124 | 2026-01-20 16:45:44.844189 | TASK [Fix machineconfigpool] 2026-01-20 16:45:44.877760 | controller | skipping: Conditional result was False 2026-01-20 16:45:44.883705 | 2026-01-20 16:45:44.883775 | TASK [Show available nodes] 2026-01-20 16:45:45.583739 | controller | NAME STATUS ROLES AGE VERSION 2026-01-20 16:45:45.585913 | controller | crc Ready control-plane,master,worker 331d v1.31.5 2026-01-20 16:45:45.913945 | controller | ok: Runtime: 0:00:00.376220 2026-01-20 16:45:45.919058 | 2026-01-20 16:45:45.919135 | TASK [Configure insecure registry inside crc vm] 2026-01-20 16:45:45.942907 | controller | skipping: Conditional result was False 2026-01-20 16:45:45.948422 | 2026-01-20 16:45:45.948490 | TASK [Catch CRC IP] 2026-01-20 16:45:46.407240 | controller | 192.168.130.11 2026-01-20 16:45:46.475550 | controller | changed 2026-01-20 16:45:46.480665 | 2026-01-20 16:45:46.480730 | TASK [Check if id_ed25519 key exists] 2026-01-20 16:45:46.863739 | controller | ok 2026-01-20 16:45:46.869332 | 2026-01-20 16:45:46.869411 | TASK [Set fact if new keypair exists] 2026-01-20 16:45:46.898407 | controller | ok 2026-01-20 16:45:46.903046 | 2026-01-20 16:45:46.903130 | TASK [Run crc] 2026-01-20 16:45:48.028811 | controller | 2026-01-20 16:45:53.484720 | controller | PLAY [OpenShift secret copy and CRC securitization] **************************** 2026-01-20 16:45:53.484781 | controller | 2026-01-20 16:45:53.484790 | controller | TASK [Gathering Facts] ********************************************************* 2026-01-20 16:45:53.484802 | controller | [WARNING]: Platform linux on host 192.168.130.11 is using the discovered Python 2026-01-20 16:45:53.522607 | controller | interpreter at /usr/bin/python3.9, but future installation of another Python 2026-01-20 16:45:53.522657 | controller | interpreter could change the meaning of that path. See 2026-01-20 16:45:53.522665 | controller | https://docs.ansible.com/ansible- 2026-01-20 16:45:53.522671 | controller | core/2.14/reference_appendices/interpreter_discovery.html for more information. 2026-01-20 16:45:53.522685 | controller | ok: [192.168.130.11] 2026-01-20 16:45:55.264511 | controller | 2026-01-20 16:45:55.264573 | controller | TASK [Copy pull-secret] ******************************************************** 2026-01-20 16:45:55.264591 | controller | changed: [192.168.130.11] 2026-01-20 16:45:56.585798 | controller | 2026-01-20 16:45:56.585854 | controller | TASK [Add crio config] ********************************************************* 2026-01-20 16:45:56.585872 | controller | changed: [192.168.130.11] 2026-01-20 16:45:59.104334 | controller | 2026-01-20 16:45:59.104383 | controller | TASK [Restart crio to pickup new configuration] ******************************** 2026-01-20 16:45:59.104401 | controller | changed: [192.168.130.11] 2026-01-20 16:45:59.154371 | controller | 2026-01-20 16:45:59.154421 | controller | PLAY RECAP ********************************************************************* 2026-01-20 16:45:59.154429 | controller | 192.168.130.11 : ok=4 changed=3 unreachable=0 failed=0 skipped=0 rescued=0 ignored=0 2026-01-20 16:45:59.154435 | controller | 2026-01-20 16:45:59.490804 | controller | changed 2026-01-20 16:45:59.496400 | 2026-01-20 16:45:59.496474 | TASK [Set slower etcd profile] 2026-01-20 16:45:59.535920 | controller | ok 2026-01-20 16:45:59.556640 | 2026-01-20 16:45:59.556734 | TASK [prepare-crc-cloud : Set slower profile] 2026-01-20 16:45:59.968619 | controller | etcd.operator.openshift.io/cluster patched 2026-01-20 16:46:00.083159 | controller | ok 2026-01-20 16:46:00.089432 | 2026-01-20 16:46:00.089517 | TASK [prepare-crc-cloud : Wait 30 seconds to apply] 2026-01-20 16:46:30.142625 | controller | ok 2026-01-20 16:46:30.147571 | 2026-01-20 16:46:30.147645 | TASK [prepare-crc-cloud : Get pod phase status] 2026-01-20 16:46:30.541262 | controller | The connection to the server api.crc.testing:6443 was refused - did you specify the right host or port? 2026-01-20 16:58:35.109629 | controller | ERROR 2026-01-20 16:58:35.109816 | controller | { 2026-01-20 16:58:35.109849 | controller | "attempts": 60, 2026-01-20 16:58:35.109870 | controller | "delta": "0:00:00.119834", 2026-01-20 16:58:35.109888 | controller | "end": "2026-01-20 16:58:35.072581", 2026-01-20 16:58:35.109904 | controller | "msg": "", 2026-01-20 16:58:35.109921 | controller | "rc": 0, 2026-01-20 16:58:35.109936 | controller | "start": "2026-01-20 16:58:34.952747" 2026-01-20 16:58:35.109951 | controller | } failure 2026-01-20 16:58:35.111045 | 2026-01-20 16:58:35.111092 | PLAY RECAP 2026-01-20 16:58:35.111134 | controller | ok: 18 changed: 9 unreachable: 0 failed: 1 skipped: 12 rescued: 0 ignored: 0 2026-01-20 16:58:35.111155 | 2026-01-20 16:58:35.184741 | PRE-RUN END RESULT_NORMAL: [trusted : review.rdoproject.org/config/playbooks/crc/simple-start.yaml@master] 2026-01-20 16:58:35.186849 | POST-RUN START: [trusted : review.rdoproject.org/config/playbooks/ci-framework-rdo-base/dlrn/dlrn-report.yaml@master] 2026-01-20 16:58:35.672442 | 2026-01-20 16:58:35.672537 | PLAY [Report DLRN results after job run] 2026-01-20 16:58:35.692130 | 2026-01-20 16:58:35.692212 | TASK [Report job status to DLRN] 2026-01-20 16:58:35.710117 | controller | ok 2026-01-20 16:58:35.733641 | 2026-01-20 16:58:35.733724 | TASK [dlrn_report : Warning if DLRN is not running] 2026-01-20 16:58:35.767593 | controller | skipping: Conditional result was False 2026-01-20 16:58:35.773367 | 2026-01-20 16:58:35.773438 | TASK [dlrn_report : Install dlrnapi-client shyaml package] 2026-01-20 16:58:35.816998 | controller | skipping: Conditional result was False 2026-01-20 16:58:35.822799 | 2026-01-20 16:58:35.822873 | TASK [dlrn_report : Install kinit related package] 2026-01-20 16:58:35.866863 | controller | skipping: Conditional result was False 2026-01-20 16:58:35.872474 | 2026-01-20 16:58:35.872543 | TASK [dlrn_report : Install dlrn kerberos related packages] 2026-01-20 16:58:35.916088 | controller | skipping: Conditional result was False 2026-01-20 16:58:35.922617 | 2026-01-20 16:58:35.922683 | TASK [Set zuul-log-path fact] 2026-01-20 16:58:35.966192 | controller | skipping: Conditional result was False 2026-01-20 16:58:35.971968 | 2026-01-20 16:58:35.972047 | TASK [dlrn_report : Set the the value of cifmw_repo_setup_promotion when multiple dlrn tags are used] 2026-01-20 16:58:36.015783 | controller | skipping: Conditional result was False 2026-01-20 16:58:36.021120 | 2026-01-20 16:58:36.021200 | TASK [Get hash related data from repo_setup role] 2026-01-20 16:58:36.064750 | controller | skipping: Conditional result was False 2026-01-20 16:58:36.070518 | 2026-01-20 16:58:36.070587 | TASK [dlrn_report : Perform kinit for DLRN kerberos authentication] 2026-01-20 16:58:36.596324 | controller | skipping: Conditional result was False 2026-01-20 16:58:36.601642 | 2026-01-20 16:58:36.601708 | TASK [dlrn_report : Set empty value for dlrnapi password] 2026-01-20 16:58:36.645353 | controller | skipping: Conditional result was False 2026-01-20 16:58:36.650634 | 2026-01-20 16:58:36.650712 | TASK [dlrn_report : Report results to dlrn for the tested hash] 2026-01-20 16:58:37.175442 | controller | skipping: Conditional result was False 2026-01-20 16:58:37.197144 | 2026-01-20 16:58:37.197216 | PLAY RECAP 2026-01-20 16:58:37.197267 | controller | ok: 0 changed: 0 unreachable: 0 failed: 0 skipped: 10 rescued: 0 ignored: 0 2026-01-20 16:58:37.197311 | 2026-01-20 16:58:37.261012 | POST-RUN END RESULT_NORMAL: [trusted : review.rdoproject.org/config/playbooks/ci-framework-rdo-base/dlrn/dlrn-report.yaml@master] 2026-01-20 16:58:37.261737 | POST-RUN START: [trusted : review.rdoproject.org/config/playbooks/base-minimal/post-ssh.yaml@master] 2026-01-20 16:58:37.745782 | 2026-01-20 16:58:37.745872 | PLAY [all] 2026-01-20 16:58:37.764169 | 2026-01-20 16:58:37.764254 | TASK [include_role : fetch-output] 2026-01-20 16:58:37.792681 | controller | ok 2026-01-20 16:58:37.809380 | 2026-01-20 16:58:37.809460 | TASK [fetch-output : Set log path for multiple nodes] 2026-01-20 16:58:37.853470 | controller | skipping: Conditional result was False 2026-01-20 16:58:37.858854 | 2026-01-20 16:58:37.858917 | TASK [fetch-output : Set log path for single node] 2026-01-20 16:58:37.887384 | controller | ok 2026-01-20 16:58:37.892258 | 2026-01-20 16:58:37.892341 | LOOP [fetch-output : Ensure local output dirs] 2026-01-20 16:58:38.199434 | controller -> localhost | ok: "/var/lib/zuul/builds/559949fc17d34b658e1f4a2b497a9a66/work/logs" 2026-01-20 16:58:38.385168 | controller -> localhost | changed: "/var/lib/zuul/builds/559949fc17d34b658e1f4a2b497a9a66/work/artifacts" 2026-01-20 16:58:38.563992 | controller -> localhost | changed: "/var/lib/zuul/builds/559949fc17d34b658e1f4a2b497a9a66/work/docs" 2026-01-20 16:58:38.572146 | 2026-01-20 16:58:38.572266 | LOOP [fetch-output : Collect logs, artifacts and docs] 2026-01-20 16:58:39.215491 | controller | changed: .d..t...... ./ 2026-01-20 16:58:39.215690 | controller | changed: All items complete 2026-01-20 16:58:39.215722 | 2026-01-20 16:58:39.688052 | controller | changed: .d..t...... ./ 2026-01-20 16:58:40.145516 | controller | changed: .d..t...... ./ 2026-01-20 16:58:40.157713 | 2026-01-20 16:58:40.157818 | TASK [include_role : fetch-output-openshift] 2026-01-20 16:58:40.171449 | controller | skipping: Conditional result was False 2026-01-20 16:58:40.177158 | 2026-01-20 16:58:40.177240 | LOOP [merge-output-to-logs : Move artifacts and docs to logs dir] 2026-01-20 16:58:40.522142 | controller -> localhost | ok: Item: artifacts Runtime: 0:00:00.006736 2026-01-20 16:58:40.708929 | controller -> localhost | ok: Item: docs Runtime: 0:00:00.006271 2026-01-20 16:58:40.741271 | 2026-01-20 16:58:40.741405 | PLAY [all] 2026-01-20 16:58:40.754999 | 2026-01-20 16:58:40.755065 | TASK [remove-build-sshkey : Remove the build SSH key from all nodes] 2026-01-20 16:58:41.199778 | controller | changed 2026-01-20 16:58:41.221159 | 2026-01-20 16:58:41.221249 | PLAY RECAP 2026-01-20 16:58:41.221311 | controller | ok: 5 changed: 4 unreachable: 0 failed: 0 skipped: 2 rescued: 0 ignored: 0 2026-01-20 16:58:41.221343 | 2026-01-20 16:58:41.290687 | POST-RUN END RESULT_NORMAL: [trusted : review.rdoproject.org/config/playbooks/base-minimal/post-ssh.yaml@master] 2026-01-20 16:58:41.291440 | POST-RUN START: [trusted : review.rdoproject.org/config/playbooks/base-minimal/post-logs.yaml@master] 2026-01-20 16:58:41.826898 | 2026-01-20 16:58:41.827000 | PLAY [localhost] 2026-01-20 16:58:41.843834 | 2026-01-20 16:58:41.843908 | TASK [generate-zuul-manifest : Generate Zuul manifest] 2026-01-20 16:58:42.144971 | localhost | changed 2026-01-20 16:58:42.149440 | 2026-01-20 16:58:42.149517 | TASK [generate-zuul-manifest : Return Zuul manifest URL to Zuul] 2026-01-20 16:58:42.177113 | localhost | ok 2026-01-20 16:58:42.184716 | 2026-01-20 16:58:42.184787 | TASK [add-fileserver : Create SSH private key tempfile] 2026-01-20 16:58:42.475641 | localhost | changed 2026-01-20 16:58:42.481088 | 2026-01-20 16:58:42.481158 | TASK [add-fileserver : Create SSH private key from secret] 2026-01-20 16:58:43.014632 | localhost | changed 2026-01-20 16:58:43.019605 | 2026-01-20 16:58:43.019673 | TASK [add-fileserver : Add fileserver ssh key] 2026-01-20 16:58:43.340813 | localhost | Identity added: /var/lib/zuul/builds/559949fc17d34b658e1f4a2b497a9a66/work/tmp/ansible.xifdznzv (/var/lib/zuul/builds/559949fc17d34b658e1f4a2b497a9a66/work/tmp/ansible.xifdznzv) 2026-01-20 16:58:43.341035 | localhost | ok: Runtime: 0:00:00.006140 2026-01-20 16:58:43.345098 | 2026-01-20 16:58:43.345164 | TASK [add-fileserver : Remove SSH private key from disk] 2026-01-20 16:58:43.554884 | localhost | ok: Runtime: 0:00:00.003956 2026-01-20 16:58:43.559509 | 2026-01-20 16:58:43.559584 | TASK [add-fileserver : Add fileserver to inventory] 2026-01-20 16:58:43.607610 | localhost | changed 2026-01-20 16:58:43.612474 | 2026-01-20 16:58:43.612541 | TASK [add-fileserver : Add fileserver server to known hosts] 2026-01-20 16:58:43.913156 | localhost | changed 2026-01-20 16:58:43.931716 | 2026-01-20 16:58:43.931778 | PLAY [localhost] 2026-01-20 16:58:43.942776 | 2026-01-20 16:58:43.942839 | TASK [Generate bulk log download script] 2026-01-20 16:58:43.961543 | localhost | ok 2026-01-20 16:58:43.973066 | 2026-01-20 16:58:43.973132 | TASK [local-log-download : Check API endpoint is defined] 2026-01-20 16:58:44.000473 | localhost | ok: All assertions passed 2026-01-20 16:58:44.004777 | 2026-01-20 16:58:44.004840 | TASK [local-log-download : Create download script] 2026-01-20 16:58:44.342538 | localhost -> localhost | changed 2026-01-20 16:58:44.350776 | 2026-01-20 16:58:44.350840 | TASK [Register quick-download link] 2026-01-20 16:58:44.368095 | localhost | ok 2026-01-20 16:58:44.403256 | 2026-01-20 16:58:44.403338 | PLAY [logserver.rdoproject.org] 2026-01-20 16:58:44.412437 | 2026-01-20 16:58:44.412498 | TASK [Set zuul-log-path fact] 2026-01-20 16:58:44.428604 | logserver.rdoproject.org | ok 2026-01-20 16:58:44.437574 | 2026-01-20 16:58:44.437644 | TASK [set-zuul-log-path-fact : Set log path for a build] 2026-01-20 16:58:44.454311 | logserver.rdoproject.org | ok 2026-01-20 16:58:44.459427 | 2026-01-20 16:58:44.459491 | TASK [upload-logs : Create log directories] 2026-01-20 16:58:46.253059 | logserver.rdoproject.org | changed 2026-01-20 16:58:46.256128 | 2026-01-20 16:58:46.256205 | TASK [upload-logs : Ensure logs are readable before uploading] 2026-01-20 16:58:46.472875 | logserver.rdoproject.org -> localhost | ok: Runtime: 0:00:00.004212 2026-01-20 16:58:46.477418 | 2026-01-20 16:58:46.477485 | TASK [upload-logs : Upload logs to log server] 2026-01-20 16:58:47.907183 | logserver.rdoproject.org | Output suppressed because no_log was given 2026-01-20 16:58:47.910066 | 2026-01-20 16:58:47.910133 | LOOP [upload-logs : Compress console log and json output] 2026-01-20 16:58:47.947759 | logserver.rdoproject.org | skipping: Conditional result was False 2026-01-20 16:58:47.955908 | logserver.rdoproject.org | skipping: Conditional result was False 2026-01-20 16:58:47.967755 | 2026-01-20 16:58:47.967837 | LOOP [upload-logs : Upload compressed console log and json output] 2026-01-20 16:58:48.001969 | logserver.rdoproject.org | skipping: Conditional result was False 2026-01-20 16:58:48.002189 | 2026-01-20 16:58:48.005357 | logserver.rdoproject.org | skipping: Conditional result was False 2026-01-20 16:58:48.015859 | 2026-01-20 16:58:48.015937 | LOOP [upload-logs : Upload console log and json output]