Skip to content

build(deps): bump github.com/onsi/ginkgo/v2 from 2.20.0 to 2.20.2 #2775

build(deps): bump github.com/onsi/ginkgo/v2 from 2.20.0 to 2.20.2

build(deps): bump github.com/onsi/ginkgo/v2 from 2.20.0 to 2.20.2 #2775

Triggered via push September 20, 2024 03:10
Status Success
Total duration 9m 51s
Artifacts 2
Matrix: build
Fit to window
Zoom out
Zoom in

Annotations

19 errors
Integration.[It] Behind proxy start CRC [openshift-preset, goproxy]: Integration#L1
Unexpected error: <cmd.CodeExitError>: error running C:\Program Files\Red Hat OpenShift Local\crc.exe start -p C:\Users\rhqp\crc-qe\pull-secret: Command stdout: stderr: level=debug msg="CRC version: 2.41.0+5122f5\n" level=debug msg="OpenShift version: 4.16.7\n" level=debug msg="MicroShift version: 4.16.7\n" level=debug msg="Running 'crc start'" level=debug msg="Total memory of system is 34359267328 bytes" level=debug msg="No new version available. The latest version is 2.41.0" level=debug msg="Checking file: C:\\Users\\rhqp\\.crc\\machines\\crc\\.crc-exist" level=info msg="Using bundle path C:\\Users\\rhqp\\.crc\\cache\\crc_hyperv_4.16.7_amd64.crcbundle" level=info msg="Checking minimum RAM requirements" level=debug msg="Total memory of system is 34359267328 bytes" level=info msg="Check if Podman binary exists in: C:\\Users\\rhqp\\.crc\\bin\\oc" level=info msg="Checking if running in a shell with administrator rights" level=debug msg="Running '$currentPrincipal = New-Object Security.Principal.WindowsPrincipal([Security.Principal.WindowsIdentity]::GetCurrent());$currentPrincipal.IsInRole([Security.Principal.WindowsBuiltInRole]::Administrator)'" level=info msg="Checking Windows release" level=debug msg="Running '(Get-ItemProperty -Path \"HKLM:\\SOFTWARE\\Microsoft\\Windows NT\\CurrentVersion\" -Name ReleaseId).ReleaseId'" level=info msg="Checking Windows edition" level=debug msg="Running '(Get-ItemProperty -Path \"HKLM:\\SOFTWARE\\Microsoft\\Windows NT\\CurrentVersion\").EditionID'" level=debug msg="Running on Windows Enterprise edition" level=info msg="Checking if Hyper-V is installed and operational" level=debug msg="Running '@(Get-Wmiobject Win32_ComputerSystem).HypervisorPresent'" level=debug msg="Running '@(Get-Service vmms).Status'" level=info msg="Checking if Hyper-V service is enabled" level=debug msg="Running '@(Get-Service vmms).Status'" level=info msg="Checking if crc-users group exists" level=debug msg="Running 'Get-LocalGroup -Name crc-users'" level=info msg="Checking if current user is in crc-users and Hyper-V admins group" level=debug msg="Running '(Get-LocalGroupMember -Group 'crc-users').Name'" level=debug msg="Checking current user is in the 'crc-user' group" level=debug msg="group members: maptc1d7479c\\rhqp" level=debug msg="Running '(Get-LocalGroupMember -SID 'S-1-5-32-578').Name'" level=debug msg="Checking current user is in the 'Hyper-v Administrators' group" level=debug msg="group members: maptc1d7479c\\rhqp" level=info msg="Checking if vsock is correctly configured" level=debug msg="Running 'Get-Item -Path \"HKLM:\\SOFTWARE\\Microsoft\\Windows NT\\CurrentVersion\\Virtualization\\GuestCommunicationServices\\00000400-FACB-11E6-BD58-64006A7986D3\"'" level=info msg="Checking if the win32 background launcher is installed" level=debug msg="Running '(Get-Item 'C:\\Program Files\\Red Hat OpenShift Local\\crc-background-launcher.exe').VersionInfo.FileVersion'" level=debug msg="Found crc-background-launcher.exe version 0.0.0.1" level=info msg="Checking if the daemon task is installed" level=debug msg="Running 'Get-ScheduledTask -TaskName crcDaemon'" level=debug msg="Running '(Get-ScheduledTask -TaskName \"crcDaemon\").Version'" level=info msg="Checking if the daemon task is running" level=debug msg="Running '(Get-ScheduledTask -TaskName \"crcDaemon\").State'" level=info msg="Checking admin helper service is running" level=debug msg="Running '(Get-Service crcAdminHelper).Status'" level=info msg="Checking SSH port availability" level=debug msg="Checking file: C:\\Users\\rhqp\\.crc\\machines\\crc\\.crc-exist" level=debug msg="Copying 'C:\\Users\\rhqp\\.crc\\cache\\crc_hyperv_4.16.7_amd64\\oc.exe' to 'C:\\Users\\rhqp\\.crc\\bin\\oc\\oc.exe'" level=debug msg="Copying 'C:\\Users\\rhqp\\.crc\\cache\\crc_hyperv_4.16.7_amd64\\podman.exe' to 'C:\\Users\\rhqp\\.crc\\bin\\podman\\podman.exe'" level=info msg="Loading bundle: crc_hyperv_4.16.7_amd64..." level=debug msg="Using secret from configuration" level=info msg="Creating CRC VM for OpenShift 4.16.7..." level=debug msg="Running pre-create checks..." level=debug msg="Running '@(Get-Module -ListAvailable hyper-v).Name | Get-Unique'" level=debug msg="Running '@([Security.Principal.WindowsPrincipal][Security.Principal.WindowsIdentity]::GetCurrent()).IsInRole(([System.Security.Principal.SecurityIdentifier]::new(\"S-1-5-32-578\")))'" level=debug msg="Creating machine..." level=debug msg="Creating VM..." level=debug msg="Running 'Hyper-V\\New-VM crc -Path 'C:\\Users\\rhqp\\.crc\\machines\\crc' -MemoryStartupBytes 10752MB'" level=debug msg="Running 'Hyper-V\\Remove-VMNetworkAdapter -VMName crc'" level=debug msg="Running 'Hyper-V\\Set-VMMemory -VMName crc -DynamicMemoryEnabled $false'" level=debug msg="Running 'Hyper-V\\Set-VMProcessor crc -Count 4'" level=debug msg="Running 'Hyper-V\\Set-VM -VMName crc -AutomaticStartAction Nothing -AutomaticStopAction ShutDown -CheckpointType Disabled'" level=debug msg="Running 'Hyper-V\\Add-VMHardDiskDrive -VMName crc -Path 'C:\\Users\\rhqp\\.crc\\machines\\crc\\crc.vhdx''" level=debug msg="Running '@(Get-VHD -Path 'C:\\Users\\rhqp\\.crc\\machines\\crc\\crc.vhdx').Size'" level=debug msg="C:\\Users\\rhqp\\.crc\\machines\\crc\\crc.vhdx is already 33285996544 bytes" level=info msg="Generating new SSH key pair..." level=info msg="Generating new password for the kubeadmin user" level=debug msg="Created C:\\Users\\rhqp\\.crc\\machines\\crc\\.crc-exist" level=debug msg="Machine successfully created" level=debug msg="Checking file: C:\\Users\\rhqp\\.crc\\machines\\crc\\.crc-exist" level=debug msg="Running 'Hyper-V\\Get-VM crc | Select-Object -ExpandProperty State'" level=debug msg="Copying 'C:\\Users\\rhqp\\.crc\\cache\\crc_hyperv_4.16.7_amd64\\oc.exe' to 'C:\\Users\\rhqp\\.crc\\bin\\oc\\oc.exe'" level=debug msg="Copying 'C:\\Users\\rhqp\\.crc\\cache\\crc_hyperv_4.16.7_amd64\\podman.exe' to 'C:\\Users\\rhqp\\.crc\\bin\\podman\\podman.exe'" level=info msg="Starting CRC VM for openshift 4.16.7..." level=debug msg="Updating CRC VM configuration" level=debug msg="Running 'Hyper-V\\Start-VM crc'" level=debug msg="Waiting for machine to be running, this may take a few minutes..." level=debug msg="retry loop: attempt 0" level=debug msg="Running 'Hyper-V\\Get-VM crc | Select-Object -ExpandProperty State'" level=debug msg="Machine is up and running!" level=debug msg="Running 'Hyper-V\\Get-VM crc | Select-Object -ExpandProperty State'" level=info msg="CRC instance is running with IP 127.0.0.1" level=debug msg="Waiting until ssh is available" level=debug msg="retry loop: attempt 0" level=debug msg="Running SSH command: exit 0" level=debug msg="Using ssh private keys: [C:\\Users\\rhqp\\.crc\\machines\\crc\\id_ed25519 C:\\Users\\rhqp\\.crc\\cache\\crc_hyperv_4.16.7_amd64\\id_ecdsa_crc]" level=debug msg="SSH command results: err: ssh: handshake failed: read tcp 127.0.0.1:50529->127.0.0.1:2222: wsarecv: An existing connection was forcibly closed by the remote host., output: " level=debug msg="error: Temporary error: ssh command error:\ncommand : exit 0\nerr : ssh: handshake failed: read tcp 127.0.0.1:50529->127.0.0.1:2222: wsarecv: An existing connection was forcibly closed by the remote host.\n - sleeping 1s" level=debug msg="retry loop: attempt 1" level=debug msg="Running SSH command: exit 0" level=debug msg="Using ssh private keys: [C:\\Users\\rhqp\\.crc\\machines\\crc\\id_ed25519 C:\\Users\\rhqp\\.crc\\cache\\crc_hyperv_4.16.7_amd64\\id_ecdsa_crc]" level=debug msg="SSH command results: err: ssh: handshake failed: read tcp 127.0.0.1:50530->127.0.0.1:2222: wsarecv: An existing connection was forcibly closed by the remote host., output: " level=debug msg="error: Temporary error: ssh command error:\ncommand : exit 0\nerr : ssh: handshake failed: read tcp 127.0.0.1:50530->127.0.0.1:2222: wsarecv: An existing connection was forcibly closed by the remote host.\n - sleeping 1s" level=debug msg="retry loop: attempt 2" level=debug msg="Running SSH command: exit 0" level=debug msg="Using ssh private keys: [C:\\Users\\rhqp\\.crc\\machines\\crc\\id_ed25519 C:\\Users\\rhqp\\.crc\\cache\\crc_hyperv_4.16.7_amd64\\id_ecdsa_crc]" level=debug msg="SSH command results: err: ssh: handshake failed: read tcp 127.0.0.1:50531->127.0.0.1:2222: wsarecv: An existing connection was forcibly closed by the remote host., output: " level=debug msg="error: Temporary error: ssh command error:\ncommand : exit 0\nerr : ssh: handshake failed: read tcp 127.0.0.1:50531->127.0.0.1:2222: wsarecv: An existing connection was forcibly closed by the remote host.\n - sleeping 1s" level=debug msg="retry loop: attempt 3" level=debug msg="Running SSH command: exit 0" level=debug msg="Using ssh private keys: [C:\\Users\\rhqp\\.crc\\machines\\crc\\id_ed25519 C:\\Users\\rhqp\\.crc\\cache\\crc_hyperv_4.16.7_amd64\\id_ecdsa_crc]" level=debug msg="SSH command results: err: <nil>, output: " level=info msg="CRC VM is running" level=debug msg="Using root access: disable core user password" level=debug msg="Running SSH command: sudo passwd --lock core" level=debug msg="SSH command results: err: <nil>, output: Locking password for user core.\npasswd: Success\n" level=debug msg="Running SSH command: cat /home/core/.ssh/authorized_keys" level=debug msg="SSH command results: err: Process exited with status 1, output: " level=info msg="Updating authorized keys..." level=debug msg="Creating /home/core/.ssh/authorized_keys with permissions 0644 in the CRC VM" level=debug msg="Running SSH command: <hidden>" level=debug msg="SSH command succeeded" level=debug msg="Running SSH command: rm /home/core/.ssh/authorized_keys.d/ignition" level=debug msg="SSH command results: err: <nil>, output: " level=debug msg="Using root access: Get device id" level=debug msg="Running SSH command: sudo /usr/sbin/blkid -t TYPE=xfs -o device" level=debug msg="SSH command results: err: <nil>, output: /dev/sda4\n" level=debug msg="Using root access: Growing /dev/sda4 partition" level=debug msg="Running SSH command: sudo /usr/bin/growpart /dev/sda 4" level=debug msg="SSH command results: err: Process exited with status 1, output: NOCHANGE: partition 4 is size 63961055. it cannot be grown\n" level=debug msg="No free space after /dev/sda4, nothing to do" level=debug msg="Using root access: make root Podman socket accessible" level=debug msg="Running SSH command: sudo chmod 777 /run/podman/ /run/podman/podman.sock" level=debug msg="SSH command results: err: <nil>, output: " level=debug msg="Running SSH command: systemctl status ovs-configuration.service" level=debug msg="SSH command results: err: Process exited with status 3, output: ○ ovs-configuration.service - Configures OVS with proper host networking configuration\n Loaded: loaded (/etc/systemd/system/ovs-configuration.service; enabled; preset: disabled)\n Active: inactive (dead)\n" level=debug msg="Using root access: Executing systemctl daemon-reload command" level=debug msg="Running SSH command: sudo systemctl daemon-reload" level=debug msg="SSH command results: err: <nil>, output: " level=debug msg="Using root access: Executing systemctl start ovs-configuration.service" level=debug msg="Running SSH command: sudo systemctl start ovs-configuration.service" level=debug msg="SSH command results: err: <nil>, output: " level=debug msg="Using root access: Update resolv.conf file" level=debug msg="Running SSH command: sudo nmcli con modify --temporary ovs-if-br-ex ipv4.dns 192.168.127.1 ipv4.dns-search crc.testing" level=debug msg="SSH command results: err: <nil>, output: " level=debug msg="Using root access: Executing systemctl daemon-reload command" level=debug msg="Running SSH command: sudo systemctl daemon-reload" level=debug msg="SSH command results: err: <nil>, output: " level=debug msg="Using root access: Executing systemctl restart NetworkManager.service" level=debug msg="Running SSH command: sudo systemctl restart NetworkManager.service" level=debug msg="SSH command results: err: <nil>, output: " level=debug msg="retry loop: attempt 0" level=debug msg="Running SSH command: host -R 3 foo.apps-crc.testing" level=debug msg="SSH command results: err: <nil>, output: foo.apps-crc.testing has address 192.168.127.2\n" level=info msg="Check internal and public DNS query..." level=debug msg="Running SSH command: curl --head quay.io --proxy http://127.0.0.1:8888 --noproxy 127.0.0.1,localhost,.testing --insecure --proxy-insecure" level=debug msg="SSH command results: err: Process exited with status 7, output: " level=warning msg="Failed public DNS query from the cluster: ssh command error:\ncommand : curl --head quay.io --proxy http://127.0.0.1:8888 --noproxy 127.0.0.1,localhost,.testing --insecure --proxy-insecure\nerr : Process exited with status 7\n : " level=info msg="Check DNS query from host..." level=debug msg="api.crc.testing resolved to [127.0.0.1]" level=info msg="Verifying validity of the kubelet certificates..." level=debug msg="Running SSH command: date --date=\"$(sudo openssl x509 -in /var/lib/kubelet/pki/kubelet-client-current.pem -noout -enddate | cut -d= -f 2)\" --iso-8601=seconds" level=debug msg="SSH command results: err: <nil>, output: 2025-08-20T06:19:22+00:00\n" level=debug msg="Running SSH command: date --date=\"$(sudo openssl x509 -in /var/lib/kubelet/pki/kubelet-server-current.pem -noout -enddate | cut -d= -f 2)\" --iso-8601=seconds" level=debug msg="SSH command results: err: <nil>, output: 2025-08-20T06:20:43+00:00\n" level=debug msg="Running SSH command: date --date=\"$(sudo openssl x509 -in /etc/kubernetes/static-pod-resources/kube-apiserver-certs/secrets/aggregator-client/tls.crt -noout -enddate | cut -d= -f 2)\" --iso-8601=seconds" level=debug msg="SSH command results: err: <nil>, output: 2025-08-20T06:21:53+00:00\n" level=info msg="Starting kubelet service" level=debug msg="Using root access: Executing systemctl daemon-reload command" level=debug msg="Running SSH command: sudo systemctl daemon-reload" level=debug msg="SSH command results: err: <nil>, output: " level=debug msg="Using root access: Executing systemctl start kubelet" level=debug msg="Running SSH command: sudo systemctl start kubelet" level=debug msg="SSH command results: err: <nil>, output: " level=info msg="Waiting for kube-apiserver availability... [takes around 2min]" level=debug msg="retry loop: attempt 0" level=debug msg="Running SSH command: timeout 5s oc get nodes --context admin --cluster crc --kubeconfig /opt/kubeconfig" level=debug msg="SSH command results: err: Process exited with status 1, output: " level=debug msg="E0920 03:46:20.400122 3777 memcache.go:265] couldn't get current server API group list: Get \"https://api.crc.testing:6443/api?timeout=32s\": dial tcp 192.168.127.2:6443: connect: connection refused\nE0920 03:46:20.401413 3777 memcache.go:265] couldn't get current server API group list: Get \"https://api.crc.testing:6443/api?timeout=32s\": dial tcp 192.168.127.2:6443: connect: connection refused\nE0920 03:46:20.402312 3777 memcache.go:265] couldn't get current server API group list: Get \"https://api.crc.testing:6443/api?timeout=32s\": dial tcp 192.168.127.2:6443: connect: connection refused\nE0920 03:46:20.404547 3777 memcache.go:265] couldn't get current server API group list: Get \"https://api.crc.testing:6443/api?timeout=32s\": dial tcp 192.168.127.2:6443: connect: connection refused\nE0920 03:46:20.405689 3777 memcache.go:265] couldn't get current server API group list: Get \"https://api.crc.testing:6443/api?timeout=32s\": dial tcp 192.168.127.2:6443: connect: connection refused\nThe connection to the server api.crc.testing:6443 was refused - did you specify the right host or port?\n" level=debug msg="error: Temporary error: ssh command error:\ncommand : timeout 5s oc get nodes --context admin --cluster crc --kubeconfig /opt/kubeconfig\nerr : Process exited with status 1\n - sleeping 1s" level=debug msg="retry loop: attempt 1" level=debug msg="Running SSH command: timeout 5s oc get nodes --context admin --cluster crc --kubeconfig /opt/kubeconfig" level=debug msg="SSH command results: err: Process exited with status 1, output: " level=debug msg="E0920 03:46:21.552556 4384 memcache.go:265] couldn't get current server API group list: Get \"https://api.crc.testing:6443/api?timeout=32s\": dial tcp 192.168.127.2:6443: connect: connection refused\nE0920 03:46:21.553596 4384 memcache.go:265] couldn't get current server API group list: Get \"https://api.crc.testing:6443/api?timeout=32s\": dial tcp 192.168.127.2:6443: connect: connection refused\nE0920 03:46:21.555600 4384 memcache.go:265] couldn't get current server API group list: Get \"https://api.crc.testing:6443/api?timeout=32s\": dial tcp 192.168.127.2:6443: connect: connection refused\nE0920 03:46:21.557966 4384 memcache.go:265] couldn't get current server API group list: Get \"https://api.crc.testing:6443/api?timeout=32s\": dial tcp 192.168.127.2:6443: connect: connection refused\nE0920 03:46:21.558920 4384 memcache.go:265] couldn't get current server API group list: Get \"https://api.crc.testing:6443/api?timeout=32s\": dial tcp 192.168.127.2:6443: connect: connection refused\nThe connection to the server api.crc.testing:6443 was refused - did you specify the right host or port?\n" level=debug msg="error: Temporary error: ssh command error:\ncommand : timeout 5s oc get nodes --context admin --cluster crc --kubeconfig /opt/kubeconfig\nerr : Process exited with status 1\n - sleeping 1s" level=debug msg="retry loop: attempt 2" level=debug msg="Running SSH command: timeout 5s oc get nodes --context admin --cluster crc --kubeconfig /opt/kubeconfig" level=debug msg="SSH command results: err: Process exited with status 124, output: " level=debug level=debug msg="error: Temporary error: ssh command error:\ncommand : timeout 5s oc get nodes --context admin --cluster crc --kubeconfig /opt/kubeconfig\nerr : Process exited with status 124\n - sleeping 1s" level=debug msg="retry loop: attempt 3" level=debug msg="Running SSH command: timeout 5s oc get nodes --context admin --cluster crc --kubeconfig /opt/kubeconfig" level=debug msg="SSH command results: err: Process exited with status 124, output: " level=debug level=debug msg="error: Temporary error: ssh command error:\ncommand : timeout 5s oc get nodes --context admin --cluster crc --kubeconfig /opt/kubeconfig\nerr : Process exited with status 124\n - sleeping 1s" level=debug msg="retry loop: attempt 4" level=debug msg="Running SSH command: timeout 5s oc get nodes --context admin --cluster crc --kubeconfig /opt/kubeconfig" level=debug msg="SSH command results: err: <nil>, output: NAME STATUS ROLES AGE VERSION\ncrc NotReady control-plane,master,worker 31d v1.29.7+6abe8a1\n" level=debug msg="NAME STATUS ROLES AGE VERSION\ncrc NotReady control-plane,master,worker 31d v1.29.7+6abe8a1\n" level=info msg="Adding proxy configuration to the cluster..." level=debug msg="Waiting for availability of resource type 'proxy'" level=debug msg="retry loop: attempt 0" level=debug msg="Running SSH command: timeout 5s oc get proxy --context admin --cluster crc --kubeconfig /opt/kubeconfig" level=debug msg="SSH command results: err: <nil>, output: NAME AGE\ncluster 31d\n" level=debug msg="NAME AGE\ncluster 31d\n" level=debug msg="Adding proxy CA cert to cluster" level=debug msg="Creating /tmp/user-ca-bundle.json with permissions 0644 in the CRC VM" level=debug msg="Running SSH command: <hidden>" level=debug msg="SSH command succeeded" level=debug msg="Running SSH command: <hidden>" level=debug msg="SSH command succeeded" level=debug msg="Patch string {\"spec\":{\"httpProxy\":\"http://127.0.0.1:8888\",\"httpsProxy\":\"http://127.0.0.1:8888\",\"noProxy\":\"127.0.0.1,localhost,.testing,.testing,127.0.0.1\",\"trustedCA\":{\"name\":\"user-ca-bundle\"}}}" level=debug msg="Running SSH command: <hidden>" level=debug msg="SSH command succeeded" level=debug msg="Waiting for availability of resource type 'configmap'" level=debug msg="retry loop: attempt 0" level=debug msg="Running SSH command: timeout 5s oc get configmap --context admin --cluster crc --kubeconfig /opt/kubeconfig" level=debug msg="SSH command results: err: <nil>, output: NAME DATA AGE\nkube-root-ca.crt 1 31d\nopenshift-service-ca.crt 1 31d\n" level=debug msg="NAME DATA AGE\nkube-root-ca.crt 1 31d\nopenshift-service-ca.crt 1 31d\n" level=debug msg="Running SSH command: timeout 30s oc delete -n openshift-machine-config-operator configmap machine-config-controller --context admin --cluster crc --kubeconfig /opt/kubeconfig" level=debug msg="SSH command results: err: Process exited with status 1, output: " level=debug msg="Waiting for availability of resource type 'lease'" level=debug msg="retry loop: attempt 0" level=debug msg="Running SSH command: timeout 5s oc get lease --context admin --cluster crc --kubeconfig /opt/kubeconfig" level=debug msg="SSH command results: err: <nil>, output: " level=debug level=debug msg="Running SSH command: timeout 30s oc delete -A lease --all --context admin --cluster crc --kubeconfig /opt/kubeconfig" level=debug msg="SSH command results: err: <nil>, output: lease.coordination.k8s.io \"crc\" deleted\nlease.coordination.k8s.io \"cluster-policy-controller-lock\" deleted\nlease.coordination.k8s.io \"kube-controller-manager\" deleted\nlease.coordination.k8s.io \"kube-scheduler\" deleted\nlease.coordination.k8s.io \"openshift-apiserver-operator-lock\" deleted\nlease.coordination.k8s.io \"cluster-authentication-operator-lock\" deleted\nlease.coordination.k8s.io \"cluster-machine-approver-leader\" deleted\nlease.coordination.k8s.io \"version\" deleted\nlease.coordination.k8s.io \"config-operator-lock\" deleted\nlease.coordination.k8s.io \"console-operator-lock\" deleted\nlease.coordination.k8s.io \"openshift-controller-manager-operator-lock\" deleted\nlease.coordination.k8s.io \"openshift-master-controllers\" deleted\nlease.coordination.k8s.io \"openshift-cluster-etcd-operator-lock\" deleted\nlease.coordination.k8s.io \"openshift-master-controllers\" deleted\nlease.coordination.k8s.io \"kube-apiserver-operator-lock\" deleted\nlease.coordination.k8s.io \"cert-regeneration-controller-lock\" deleted\nlease.coordination.k8s.io \"kube-controller-manager-operator-lock\" deleted\nlease.coordination.k8s.io \"cert-recovery-controller-lock\" deleted\nlease.coordination.k8s.io \"cluster-policy-controller-lock\" deleted\nlease.coordination.k8s.io \"openshift-cluster-kube-scheduler-operator-lock\" deleted\nlease.coordination.k8s.io \"cert-recovery-controller-lock\" deleted\nlease.coordination.k8s.io \"kube-scheduler\" deleted\nlease.coordination.k8s.io \"openshift-kube-storage-version-migrator-operator-lock\" deleted\nlease.coordination.k8s.io \"control-plane-machine-set-leader\" deleted\nlease.coordination.k8s.io \"machine-api-operator\" deleted\nlease.coordination.k8s.io \"machine-config\" deleted\nlease.coordination.k8s.io \"machine-config-controller\" deleted\nlease.coordination.k8s.io \"marketplace-operator-lock\" deleted\nlease.coordination.k8s.io \"ovnkube-identity\" deleted\nlease.coordination.k8s.io \"network-operator-lock\" deleted\nlease.coordination.k8s.io \"packageserver-controller-lock\" deleted\nlease.coordination.k8s.io \"ovn-kubernetes-master\" deleted\nlease.coordination.k8s.io \"openshift-route-controllers\" deleted\nlease.coordination.k8s.io \"service-ca-operator-lock\" deleted\nlease.coordination.k8s.io \"service-ca-controller-lock\" deleted\n" level=debug msg="Waiting for availability of resource type 'secret'" level=debug msg="retry loop: attempt 0" level=debug msg="Running SSH command: timeout 5s oc get secret --context admin --cluster crc --kubeconfig /opt/kubeconfig" level=debug msg="SSH command results: err: <nil>, output: NAME TYPE DATA AGE\nbuilder-dockercfg-5gn6x kubernetes.io/dockercfg 1 30d\ndefault-dockercfg-5mnnm kubernetes.io/dockercfg 1 30d\ndeployer-dockercfg-psgvx kubernetes.io/dockercfg 1 30d\n" level=debug msg="NAME TYPE DATA AGE\nbuilder-dockercfg-5gn6x kubernetes.io/dockercfg 1 30d\ndefault-dockercfg-5mnnm kubernetes.io/dockercfg 1 30d\ndeployer-dockercfg-psgvx kubernetes.io/dockercfg 1 30d\n" level=debug msg="Running SSH command: <hidden>" level=debug msg="SSH command succeeded" level=info msg="Adding user's pull secret to the cluster..." level=debug msg="Running SSH command: <hidden>" level=debug msg="SSH command succeeded" level=debug msg="Waiting for availability of resource type 'machineconfigs'" level=debug msg="retry loop: attempt 0" level=debug msg="Running SSH command: timeout 5s oc get machineconfigs --context admin --cluster crc --kubeconfig /opt/kubeconfig" level=debug msg="SSH command results: err: <nil>, output: NAME GENERATEDBYCONTROLLER IGNITIONVERSION AGE\n00-master 64434515dba546949bcec20be26f3215a4fc5b53 3.4.0 31d\n00-worker 64434515dba546949bcec20be26f3215a4fc5b53 3.4.0 31d\n01-master-container-runtime 64434515dba546949bcec20be26f3215a4fc5b53 3.4.0 31d\n01-master-kubelet 64434515dba546949bcec20be26f3215a4fc5b53 3.4.0 31d\n01-worker-container-runtime 64434515dba546949bcec20be26f3215a4fc5b53 3.4.0 31d\n01-worker-kubelet 64434515dba546949bcec20be26f3215a4fc5b53 3.4.0 31d\n97-master-generated-kubelet 64434515dba546949bcec20be26f3215a4fc5b53 3.4.0 31d\n97-worker-generated-kubelet 64434515dba546949bcec20be26f3215a4fc5b53 3.4.0 31d\n98-master-generated-kubelet 64434515dba546949bcec20be26f3215a4fc5b53 3.4.0 31d\n98-worker-generated-kubelet 64434515dba546949bcec20be26f3215a4fc5b53 3.4.0 31d\n99-master-generated-registries 64434515dba546949bcec20be26f3215a4fc5b53 3.4.0 31d\n99-master-ssh 3.2.0 31d\n99-node-sizing-for-crc 3.2.0 31d\n99-openshift-machineconfig-master-dummy-networks 3.2.0 31d\n99-worker-generated-registries 64434515dba546949bcec20be26f3215a4fc5b53 3.4.0 31d\n99-worker-ssh 3.2.0 31d\nrendered-master-af3c83ca74c63b4b8a3a3381b9851b1f 64434515dba546949bcec20be26f3215a4fc5b53 3.4.0 30d\nrendered-worker-b45d4d2f8d21449c9543a709a1728281 64434515dba546949bcec20be26f3215a4fc5b53 3.4.0 30d\n" level=debug msg="NAME GENERATEDBYCONTROLLER IGNITIONVERSION AGE\n00-master 64434515dba546949bcec20be26f3215a4fc5b53 3.4.0 31d\n00-worker 64434515dba546949bcec20be26f3215a4fc5b53 3.4.0 31d\n01-master-container-runtime 64434515dba546949bcec20be26f3215a4fc5b53 3.4.0 31d\n01-master-kubelet 64434515dba546949bcec20be26f3215a4fc5b53 3.4.0 31d\n01-worker-container-runtime 64434515dba546949bcec20be26f3215a4fc5b53 3.4.0 31d\n01-worker-kubelet 64434515dba546949bcec20be26f3215a4fc5b53 3.4.0 31d\n97-master-generated-kubelet 64434515dba546949bcec20be26f3215a4fc5b53 3.4.0 31d\n97-worker-generated-kubelet 64434515dba546949bcec20be26f3215a4fc5b53 3.4.0 31d\n98-master-generated-kubelet 64434515dba546949bcec20be26f3215a4fc5b53 3.4.0 31d\n98-worker-generated-kubelet 64434515dba546949bcec20be26f3215a4fc5b53 3.4.0 31d\n99-master-generated-registries 64434515dba546949bcec20be26f3215a4fc5b53 3.4.0 31d\n99-master-ssh 3.2.0 31d\n99-node-sizing-for-crc 3.2.0 31d\n99-openshift-machineconfig-master-dummy-networks 3.2.0 31d\n99-worker-generated-registries 64434515dba546949bcec20be26f3215a4fc5b53 3.4.0 31d\n99-worker-ssh 3.2.0 31d\nrendered-master-af3c83ca74c63b4b8a3a3381b9851b1f 64434515dba546949bcec20be26f3215a4fc5b53 3.4.0 30d\nrendered-worker-b45d4d2f8d21449c9543a709a1728281 64434515dba546949bcec20be26f3215a4fc5b53 3.4.0 30d\n" level=debug msg="Running SSH command: timeout 30s oc get machineconfigs 99-master-ssh -o jsonpath='{.spec.config.passwd.users[0].sshAuthorizedKeys[0]}' --context admin --cluster crc --kubeconfig /opt/kubeconfig" level=debug msg="SSH command results: err: <nil>, output: ecdsa-sha2-nistp521 AAAAE2VjZHNhLXNoYTItbmlzdHA1MjEAAAAIbmlzdHA1MjEAAACFBAGo7QohLVAqqGVvlr9xGFnS/8At93YOTDqpDi05eyDxzpFgZSc5nqWFPrCv70ubLDd1qAwPir3JUEbs+F0kotqPdwE+4vItHSCzZ62kDhYSPZ7e3R+WmobL6/yfelSEG0JPm9ICmINYYoYKsTu515DedwVGj2Z6m943Kp3o+odLkewMlw== core" level=info msg="Updating SSH key to machine config resource..." level=debug msg="Running SSH command: timeout 30s oc patch machineconfig 99-master-ssh -p '{\"spec\": {\"config\": {\"passwd\": {\"users\": [{\"name\": \"core\", \"sshAuthorizedKeys\": [\"ssh-ed25519 AAAAC3NzaC1lZDI1NTE5AAAAIGu2GbRroyjZFdmuEn7dCRWOwguouFzSR7eHiDPjssSh\"]}]}}}}' --type merge --context admin --cluster crc --kubeconfig /opt/kubeconfig" level=debug msg="SSH command results: err: <nil>, output: machineconfig.machineconfiguration.openshift.io/99-master-ssh patched\n" level=info msg="Waiting until the user's pull secret is written to the instance disk..." level=debug msg="retry loop: attempt 0" level=debug msg="Running SSH command: <hidden>" level=debug msg="SSH command succeeded" level=debug msg="error: Temporary error: pull secret not updated to disk - sleeping 2s" level=debug msg="retry loop: attempt 1" level=debug msg="Running SSH command: <hidden>" level=debug msg="SSH command succeeded" level=debug msg="error: Temporary error: pull secret not updated to disk - sleeping 2s" level=debug msg="retry loop: attempt 2" level=debug msg="Running SSH command: <hidden>" level=debug msg="SSH command succeeded" level=debug msg="error: Temporary error: pull secret not updated to disk - sleeping 2s" level=debug msg="retry loop: attempt 3" level=debug msg="Running SSH command: <hidden>" level=debug msg="SSH command succeeded" level=debug msg="error: Temporary error: pull secret not updated to disk - sleeping 2s" level=debug msg="retry loop: attempt 4" level=debug msg="Running SSH command: <hidden>" level=debug msg="SSH command succeeded" level=debug msg="error: Temporary error: pull secret not updated to disk - sleeping 2s" level=debug msg="retry loop: attempt 5" level=debug msg="Running SSH command: <hidden>" level=debug msg="SSH command succeeded" level=debug msg="error: Temporary error: pull secret not updated to disk - sleeping 2s" level=debug msg="retry loop: attempt 6" level=debug msg="Running SSH command: <hidden>" level=debug msg="SSH command succeeded" level=debug msg="error: Temporary error: pull secret not updated to disk - sleeping 2s" level=debug msg="retry loop: attempt 7" level=debug msg="Running SSH command: <hidden>" level=debug msg="SSH command succeeded" level=debug msg="error: Temporary error: pull secret not updated to disk - sleeping 2s" level=debug msg="retry loop: attempt 8" level=debug msg="Running SSH command: <hidden>" level=debug msg="SSH command succeeded" level=debug msg="error: Temporary error: pull secret not updated to disk - sleeping 2s" level=debug msg="retry loop: attempt 9" level=debug msg="Running SSH command: <hidden>" level=debug msg="SSH command succeeded" level=debug msg="error: Temporary error: pull secret not updated to disk - sleeping 2s" level=debug msg="retry loop: attempt 10" level=debug msg="Running SSH command: <hidden>" level=debug msg="SSH command succeeded" level=debug msg="error: Temporary error: pull secret not updated to disk - sleeping 2s" level=debug msg="retry loop: attempt 11" level=debug msg="Running SSH command: <hidden>" level=debug msg="SSH command succeeded" level=debug msg="error: Temporary error: pull secret not updated to disk - sleeping 2s" level=debug msg="retry loop: attempt 12" level=debug msg="Running SSH command: <hidden>" level=debug msg="SSH command succeeded" level=debug msg="error: Temporary error: pull secret not updated to disk - sleeping 2s" level=debug msg="retry loop: attempt 13" level=debug msg="Running SSH command: <hidden>" level=debug msg="SSH command succeeded" level=debug msg="error: Temporary error: pull secret not updated to disk - sleeping 2s" level=debug msg="retry loop: attempt 14" level=debug msg="Running SSH command: <hidden>" level=debug msg="SSH command succeeded" level=debug msg="error: Temporary error: pull secret not updated to disk - sleeping 2s" level=debug msg="retry loop: attempt 15" level=debug msg="Running SSH command: <hidden>" level=debug msg="SSH command succeeded" level=debug msg="error: Temporary error: pull secret not updated to disk - sleeping 2s" level=debug msg="retry loop: attempt 16" level=debug msg="Running SSH command: <hidden>" level=debug msg="SSH command succeeded" level=debug msg="error: Temporary error: pull secret not updated to disk - sleeping 2s" level=debug msg="retry loop: attempt 17" level=debug msg="Running SSH command: <hidden>" level=debug msg="SSH command succeeded" level=debug msg="error: Temporary error: pull secret not updated to disk - sleeping 2s" level=debug msg="retry loop: attempt 18" level=debug msg="Running SSH command: <hidden>" level=debug msg="SSH command succeeded" level=debug msg="error: Temporary error: pull secret not updated to disk - sleeping 2s" level=debug msg="retry loop: attempt 19" level=debug msg="Running SSH command: <hidden>" level=debug msg="SSH command succeeded" level=debug msg="error: Temporary error: pull secret not updated to disk - sleeping 2s" level=debug msg="retry loop: attempt 20" level=debug msg="Running SSH command: <hidden>" level=debug msg="SSH command succeeded" level=debug msg="error: Temporary error: pull secret not updated to disk - sleeping 2s" level=debug msg="retry loop: attempt 21" level=debug msg="Running SSH command: <hidden>" level=debug msg="SSH command succeeded" level=debug msg="error: Temporary error: pull secret not updated to disk - sleeping 2s" level=debug msg="retry loop: attempt 22" level=debug msg="Running SSH command: <hidden>" level=debug msg="SSH command succeeded" level=debug msg="error: Temporary error: pull secret not updated to disk - sleeping 2s" level=debug msg="retry loop: attempt 23" level=debug msg="Running SSH command: <hidden>" level=debug msg="SSH command succeeded" level=debug msg="error: Temporary error: pull secret not updated to disk - sleeping 2s" level=debug msg="retry loop: attempt 24" level=debug msg="Running SSH command: <hidden>" level=debug msg="SSH command succeeded" level=debug msg="error: Temporary error: pull secret not updated to disk - sleeping 2s" level=debug msg="retry loop: attempt 25" level=debug msg="Running SSH command: <hidden>" level=debug msg="SSH command succeeded" level=debug msg="error: Temporary error: pull secret not updated to disk - sleeping 2s" level=debug msg="retry loop: attempt 26" level=debug msg="Running SSH command: <hidden>" level=debug msg="SSH command succeeded" level=debug msg="error: Temporary error: pull secret not updated to disk - sleeping 2s" level=debug msg="retry loop: attempt 27" level=debug msg="Running SSH command: <hidden>" level=debug msg="SSH command succeeded" level=debug msg="error: Temporary error: pull secret not updated to disk - sleeping 2s" level=debug msg="retry loop: attempt 28" level=debug msg="Running SSH command: <hidden>" level=debug msg="SSH command succeeded" level=debug msg="error: Temporary error: pull secret not updated to disk - sleeping 2s" level=debug msg="retry loop: attempt 29" level=debug msg="Running SSH command: <hidden>" level=debug msg="SSH command succeeded" level=debug msg="error: Temporary error: pull secret not updated to disk - sleeping 2s" level=debug msg="retry loop: attempt 30" level=debug msg="Running SSH command: <hidden>" level=debug msg="SSH command succeeded" level=debug msg="error: Temporary error: pull secret not updated to disk - sleeping 2s" level=debug msg="retry loop: attempt 31" level=debug msg="Running SSH command: <hidden>" level=debug msg="SSH command succeeded" level=debug msg="error: Temporary error: pull secret not updated to disk - sleeping 2s" level=debug msg="retry loop: attempt 32" level=debug msg="Running SSH command: <hidden>" level=debug msg="SSH command succeeded" level=debug msg="error: Temporary error: pull secret not updated to disk - sleeping 2s" level=debug msg="retry loop: attempt 33" level=debug msg="Running SSH command: <hidden>" level=debug msg="SSH command succeeded" level=debug msg="error: Temporary error: pull secret not updated to disk - sleeping 2s" level=debug msg="retry loop: attempt 34" level=debug msg="Running SSH command: <hidden>" level=debug msg="SSH command succeeded" level=debug msg="error: Temporary error: pull secret not updated to disk - sleeping 2s" level=debug msg="retry loop: attempt 35" level=debug msg="Running SSH command: <hidden>" level=debug msg="SSH command succeeded" level=debug msg="error: Temporary error: pull secret not updated to disk - sleeping 2s" level=debug msg="retry loop: attempt 36" level=debug msg="Running SSH command: <hidden>" level=debug msg="SSH command succeeded" level=debug msg="error: Temporary error: pull secret not updated to disk - sleeping 2s" level=debug msg="retry loop: attempt 37" level=debug msg="Running SSH command: <hidden>" level=debug msg="SSH command succeeded" level=debug msg="error: Temporary error: pull secret not updated to disk - sleeping 2s" level=debug msg="retry loop: attempt 38" level=debug msg="Running SSH command: <hidden>" level=debug msg="SSH command succeeded" level=debug msg="error: Temporary error: pull secret not updated to disk - sleeping 2s" level=debug msg="retry loop: attempt 39" level=debug msg="Running SSH command: <hidden>" level=debug msg="SSH command succeeded" level=debug msg="error: Temporary error: pull secret not updated to disk - sleeping 2s" level=debug msg="retry loop: attempt 40" level=debug msg="Running SSH command: <hidden>" level=debug msg="SSH command succeeded" level=debug msg="error: Temporary error: pull secret not updated to disk - sleeping 2s" level=debug msg="retry loop: attempt 41" level=debug msg="Running SSH command: <hidden>" level=debug msg="SSH command succeeded" level=debug msg="error: Temporary error: pull secret not updated to disk - sleeping 2s" level=debug msg="retry loop: attempt 42" level=debug msg="Running SSH command: <hidden>" level=debug msg="SSH command succeeded" level=debug msg="error: Temporary error: pull secret not updated to disk - sleeping 2s" level=debug msg="retry loop: attempt 43" level=debug msg="Running SSH command: <hidden>" level=debug msg="SSH command succeeded" level=debug msg="error: Temporary error: pull secret not updated to disk - sleeping 2s" level=debug msg="retry loop: attempt 44" level=debug msg="Running SSH command: <hidden>" level=debug msg="SSH command succeeded" level=debug msg="error: Temporary error: pull secret not updated to disk - sleeping 2s" level=debug msg="retry loop: attempt 45" level=debug msg="Running SSH command: <hidden>" level=debug msg="SSH command succeeded" level=debug msg="error: Temporary error: pull secret not updated to disk - sleeping 2s" level=debug msg="retry loop: attempt 46" level=debug msg="Running SSH command: <hidden>" level=debug msg="SSH command succeeded" level=debug msg="error: Temporary error: pull secret not updated to disk - sleeping 2s" level=debug msg="retry loop: attempt 47" level=debug msg="Running SSH command: <hidden>" level=debug msg="SSH command succeeded" level=debug msg="error: Temporary error: pull secret not updated to disk - sleeping 2s" level=debug msg="retry loop: attempt 48" level=debug msg="Running SSH command: <hidden>" level=debug msg="SSH command succeeded" level=debug msg="error: Temporary error: pull secret not updated to disk - sleeping 2s" level=debug msg="retry loop: attempt 49" level=debug msg="Running SSH command: <hidden>" level=debug msg="SSH command succeeded" level=debug msg="error: Temporary error: pull secret not updated to disk - sleeping 2s" level=debug msg="retry loop: attempt 50" level=debug msg="Running SSH command: <hidden>" level=debug msg="SSH command succeeded" level=debug msg="error: Temporary error: pull secret not updated to disk - sleeping 2s" level=debug msg="retry loop: attempt 51" level=debug msg="Running SSH command: <hidden>" level=debug msg="SSH command succeeded" level=debug msg="error: Temporary error: pull secret not updated to disk - sleeping 2s" level=debug msg="retry loop: attempt 52" level=debug msg="Running SSH command: <hidden>" level=debug msg="SSH command succeeded" level=debug msg="error: Temporary error: pull secret not updated to disk - sleeping 2s" level=debug msg="retry loop: attempt 53" level=debug msg="Running SSH command: <hidden>" level=debug msg="SSH command succeeded" level=debug msg="error: Temporary error: pull secret not updated to disk - sleeping 2s" level=debug msg="retry loop: attempt 54" level=debug msg="Running SSH command: <hidden>" level=debug msg="SSH command succeeded" level=debug msg="error: Temporary error: pull secret not updated to disk - sleeping 2s" level=debug msg="retry loop: attempt 55" level=debug msg="Running SSH command: <hidden>" level=debug msg="SSH command succeeded" level=debug msg="error: Temporary error: pull secret not updated to disk - sleeping 2s" level=debug msg="retry loop: attempt 56" level=debug msg="Running SSH command: <hidden>" level=debug msg="SSH command succeeded" level=debug msg="error: Temporary error: pull secret not updated to disk - sleeping 2s" level=debug msg="retry loop: attempt 57" level=debug msg="Running SSH command: <hidden>" level=debug msg="SSH command succeeded" level=debug msg="error: Temporary error: pull secret not updated to disk - sleeping 2s" level=debug msg="retry loop: attempt 58" level=debug msg="Running SSH command: <hidden>" level=debug msg="SSH command succeeded" level=debug msg="error: Temporary error: pull secret not updated to disk - sleeping 2s" level=debug msg="retry loop: attempt 59" level=debug msg="Running SSH command: <hidden>" level=debug msg="SSH command succeeded" level=debug msg="error: Temporary error: pull secret not updated to disk - sleeping 2s" level=debug msg="retry loop: attempt 60" level=debug msg="Running SSH command: <hidden>" level=debug msg="SSH command succeeded" level=debug msg="error: Temporary error: pull secret not updated to disk - sleeping 2s" level=debug msg="retry loop: attempt 61" level=debug msg="Running SSH command: <hidden>" level=debug msg="SSH command succeeded" level=debug msg="Waiting for availability of resource type 'secret'" level=debug msg="retry loop: attempt 0" level=debug msg="Running SSH command: timeout 5s oc get secret --context admin --cluster crc --kubeconfig /opt/kubeconfig" level=debug msg="SSH command results: err: Process exited with status 124, output: " level=debug level=debug msg="error: Temporary error: ssh command error:\ncommand : timeout 5s oc get secret --context admin --cluster crc --kubeconfig /opt/kubeconfig\nerr : Process exited with status 124\n - sleeping 1s" level=debug msg="retry loop: attempt 1" level=debug msg="Running SSH command: timeout 5s oc get secret --context admin --cluster crc --kubeconfig /opt/kubeconfig" level=debug msg="SSH command results: err: Process exited with status 124, output: " level=debug level=debug msg="error: Temporary error: ssh command error:\ncommand : timeout 5s oc get secret --context admin --cluster crc --kubeconfig /opt/kubeconfig\nerr : Process exited with status 124\n - sleeping 1s" level=debug msg="retry loop: attempt 2" level=debug msg="Running SSH command: timeout 5s oc get secret --context admin --cluster crc --kubeconfig /opt/kubeconfig" level=debug msg="SSH command results: err: Process exited with status 1, output: " level=debug msg="The connection to the server api.crc.testing:6443 was refused - did you specify the right host or port?\n" level=debug msg="error: Temporary error: ssh command error:\ncommand : timeout 5s oc get secret --context admin --cluster crc --kubeconfig /opt/kubeconfig\nerr : Process exited with status 1\n - sleeping 1s" level=debug msg="retry loop: attempt 3" level=debug msg="Running SSH command: timeout 5s oc get secret --context admin --cluster crc --kubeconfig /opt/kubeconfig" level=debug msg="SSH command results: err: Process exited with status 1, output: " level=debug msg="The connection to the server api.crc.testing:6443 was refused - did you specify the right host or port?\n" level=debug msg="error: Temporary error: ssh command error:\ncommand : timeout 5s oc get secret --context admin --cluster crc --kubeconfig /opt/kubeconfig\nerr : Process exited with status 1\n - sleeping 1s" level=debug msg="retry loop: attempt 4" level=debug msg="Running SSH command: timeout 5s oc get secret --context admin --cluster crc --kubeconfig /opt/kubeconfig" level=debug msg="SSH command results: err: Process exited with status 1, output: " level=debug msg="The connection to the server api.crc.testing:6443 was refused - did you specify the right host or port?\n" level=debug msg="error: Temporary error: ssh command error:\ncommand : timeout 5s oc get secret --context admin --cluster crc --kubeconfig /opt/kubeconfig\nerr : Process exited with status 1\n - sleeping 1s" level=debug msg="retry loop: attempt 5" level=debug msg="Running SSH command: timeout 5s oc get secret --context admin --cluster crc --kubeconfig /opt/kubeconfig" level=debug msg="SSH command results: err: Process exited with status 1, output: " level=debug msg="The connection to the server api.crc.testing:6443 was refused - did you specify the right host or port?\n" level=debug msg="error: Temporary error: ssh command error:\ncommand : timeout 5s oc get secret --context admin --cluster crc --kubeconfig /opt/kubeconfig\nerr : Process exited with status 1\n - sleeping 1s" level=debug msg="retry loop: attempt 6" level=debug msg="Running SSH command: timeout 5s oc get secret --context admin --cluster crc --kubeconfig /opt/kubeconfig" level=debug msg="SSH command results: err: Process exited with status 1, output: " level=debug msg="The connection to the server api.crc.testing:6443 was refused - did you specify the right host or port?\n" level=debug msg="error: Temporary error: ssh command error:\ncommand : timeout 5s oc get secret --context admin --cluster crc --kubeconfig /opt/kubeconfig\nerr : Process exited with status 1\n - sleeping 1s" level=debug msg="retry loop: attempt 7" level=debug msg="Running SSH command: timeout 5s oc get secret --context admin --cluster crc --kubeconfig /opt/kubeconfig" level=debug msg="SSH command results: err: Process exited with status 1, output: " level=debug msg="The connection to the server api.crc.testing:6443 was refused - did you specify the right host or port?\n" level=debug msg="error: Temporary error: ssh command error:\ncommand : timeout 5s oc get secret --context admin --cluster crc --kubeconfig /opt/kubeconfig\nerr : Process exited with status 1\n - sleeping 1s" level=debug msg="retry loop: attempt 8" level=debug msg="Running SSH command: timeout 5s oc get secret --context admin --cluster crc --kubeconfig /opt/kubeconfig" level=debug msg="SSH command results: err: Process exited with status 1, output: " level=debug msg="The connection to the server api.crc.testing:6443 was refused - did you specify the right host or port?\n" level=debug msg="error: Temporary error: ssh command error:\ncommand : timeout 5s oc get secret --context admin --cluster crc --kubeconfig /opt/kubeconfig\nerr : Process exited with status 1\n - sleeping 1s" level=debug msg="retry loop: attempt 9" level=debug msg="Running SSH command: timeout 5s oc get secret --context admin --cluster crc --kubeconfig /opt/kubeconfig" level=debug msg="SSH command results: err: Process exited with status 1, output: " level=debug msg="The connection to the server api.crc.testing:6443 was refused - did you specify the right host or port?\n" level=debug msg="error: Temporary error: ssh command error:\ncommand : timeout 5s oc get secret --context admin --cluster crc --kubeconfig /opt/kubeconfig\nerr : Process exited with status 1\n - sleeping 1s" level=debug msg="retry loop: attempt 10" level=debug msg="Running SSH command: timeout 5s oc get secret --context admin --cluster crc --kubeconfig /opt/kubeconfig" level=debug msg="SSH command results: err: Process exited with status 1, output: " level=debug msg="The connection to the server api.crc.testing:6443 was refused - did you specify the right host or port?\n" level=debug msg="error: Temporary error: ssh command error:\ncommand : timeout 5s oc get secret --context admin --cluster crc --kubeconfig /opt/kubeconfig\nerr : Process exited with status 1\n - sleeping 1s" level=debug msg="retry loop: attempt 11" level=debug msg="Running SSH command: timeout 5s oc get secret --context admin --cluster crc --kubeconfig /opt/kubeconfig" level=debug msg="SSH command results: err: Process exited with status 1, output: " level=debug msg="The connection to the server api.crc.testing:6443 was refused - did you specify the right host or port?\n" level=debug msg="error: Temporary error: ssh command error:\ncommand : timeout 5s oc get secret --context admin --cluster crc --kubeconfig /opt/kubeconfig\nerr : Process exited with status 1\n - sleeping 1s" level=debug msg="retry loop: attempt 12" level=debug msg="Running SSH command: timeout 5s oc get secret --context admin --cluster crc --kubeconfig /opt/kubeconfig" level=debug msg="SSH command results: err: Process exited with status 1, output: " level=debug msg="The connection to the server api.crc.testing:6443 was refused - did you specify the right host or port?\n" level=debug msg="error: Temporary error: ssh command error:\ncommand : timeout 5s oc get secret --context admin --cluster crc --kubeconfig /opt/kubeconfig\nerr : Process exited with status 1\n - sleeping 1s" level=debug msg="retry loop: attempt 13" level=debug msg="Running SSH command: timeout 5s oc get secret --context admin --cluster crc --kubeconfig /opt/kubeconfig" level=debug msg="SSH command results: err: Process exited with status 1, output: " level=debug msg="The connection to the server api.crc.testing:6443 was refused - did you specify the right host or port?\n" level=debug msg="error: Temporary error: ssh command error:\ncommand : timeout 5s oc get secret --context admin --cluster crc --kubeconfig /opt/kubeconfig\nerr : Process exited with status 1\n - sleeping 1s" level=debug msg="retry loop: attempt 14" level=debug msg="Running SSH command: timeout 5s oc get secret --context admin --cluster crc --kubeconfig /opt/kubeconfig" level=debug msg="SSH command results: err: Process exited with status 1, output: " level=debug msg="The connection to the server api.crc.testing:6443 was refused - did you specify the right host or port?\n" level=debug msg="error: Temporary error: ssh command error:\ncommand : timeout 5s oc get secret --context admin --cluster crc --kubeconfig /opt/kubeconfig\nerr : Process exited with status 1\n - sleeping 1s" level=debug msg="retry loop: attempt 15" level=debug msg="Running SSH command: timeout 5s oc get secret --context admin --cluster crc --kubeconfig /opt/kubeconfig" level=debug msg="SSH command results: err: Process exited with status 1, output: " level=debug msg="The connection to the server api.crc.testing:6443 was refused - did you specify the right host or port?\n" level=debug msg="error: Temporary error: ssh command error:\ncommand : timeout 5s oc get secret --context admin --cluster crc --kubeconfig /opt/kubeconfig\nerr : Process exited with status 1\n - sleeping 1s" level=debug msg="retry loop: attempt 16" level=debug msg="Running SSH command: timeout 5s oc get secret --context admin --cluster crc --kubeconfig /opt/kubeconfig" level=debug msg="SSH command results: err: Process exited with status 1, output: " level=debug msg="The connection to the server api.crc.testing:6443 was refused - did you specify the right host or port?\n" level=debug msg="error: Temporary error: ssh command error:\ncommand : timeout 5s oc get secret --context admin --cluster crc --kubeconfig /opt/kubeconfig\nerr : Process exited with status 1\n - sleeping 1s" level=debug msg="retry loop: attempt 17" level=debug msg="Running SSH command: timeout 5s oc get secret --context admin --cluster crc --kubeconfig /opt/kubeconfig" level=debug msg="SSH command results: err: Process exited with status 1, output: " level=debug msg="The connection to the server api.crc.testing:6443 was refused - did you specify the right host or port?\n" level=debug msg="error: Temporary error: ssh command error:\ncommand : timeout 5s oc get secret --context admin --cluster crc --kubeconfig /opt/kubeconfig\nerr : Process exited with status 1\n - sleeping 1s" level=debug msg="retry loop: attempt 18" level=debug msg="Running SSH command: timeout 5s oc get secret --context admin --cluster crc --kubeconfig /opt/kubeconfig" level=debug msg="SSH command results: err: Process exited with status 1, output: " level=debug msg="The connection to the server api.crc.testing:6443 was refused - did you specify the right host or port?\n" level=debug msg="error: Temporary error: ssh command error:\ncommand : timeout 5s oc get secret --context admin --cluster crc --kubeconfig /opt/kubeconfig\nerr : Process exited with status 1\n - sleeping 1s" level=debug msg="retry loop: attempt 19" level=debug msg="Running SSH command: timeout 5s oc get secret --context admin --cluster crc --kubeconfig /opt/kubeconfig" level=debug msg="SSH command results: err: Process exited with status 1, output: " level=debug msg="The connection to the server api.crc.testing:6443 was refused - did you specify the right host or port?\n" level=debug msg="error: Temporary error: ssh command error:\ncommand : timeout 5s oc get secret --context admin --cluster crc --kubeconfig /opt/kubeconfig\nerr : Process exited with status 1\n - sleeping 1s" level=debug msg="retry loop: attempt 20" level=debug msg="Running SSH command: timeout 5s oc get secret --context admin --cluster crc --kubeconfig /opt/kubeconfig" level=debug msg="SSH command results: err: Process exited with status 1, output: " level=debug msg="The connection to the server api.crc.testing:6443 was refused - did you specify the right host or port?\n" level=debug msg="error: Temporary error: ssh command error:\ncommand : timeout 5s oc get secret --context admin --cluster crc --kubeconfig /opt/kubeconfig\nerr : Process exited with status 1\n - sleeping 1s" level=debug msg="retry loop: attempt 21" level=debug msg="Running SSH command: timeout 5s oc get secret --context admin --cluster crc --kubeconfig /opt/kubeconfig" level=debug msg="SSH command results: err: Process exited with status 1, output: " level=debug msg="The connection to the server api.crc.testing:6443 was refused - did you specify the right host or port?\n" level=debug msg="error: Temporary error: ssh command error:\ncommand : timeout 5s oc get secret --context admin --cluster crc --kubeconfig /opt/kubeconfig\nerr : Process exited with status 1\n - sleeping 1s" level=debug msg="retry loop: attempt 22" level=debug msg="Running SSH command: timeout 5s oc get secret --context admin --cluster crc --kubeconfig /opt/kubeconfig" level=debug msg="SSH command results: err: Process exited with status 1, output: " level=debug msg="The connection to the server api.crc.testing:6443 was refused - did you specify the right host or port?\n" level=debug msg="error: Temporary error: ssh command error:\ncommand : timeout 5s oc get secret --context admin --cluster crc --kubeconfig /opt/kubeconfig\nerr : Process exited with status 1\n - sleeping 1s" level=debug msg="retry loop: attempt 23" level=debug msg="Running SSH command: timeout 5s oc get secret --context admin --cluster crc --kubeconfig /opt/kubeconfig" level=debug msg="SSH command results: err: Process exited with status 1, output: " level=debug msg="The connection to the server api.crc.testing:6443 was refused - did you specify the right host or port?\n" level=debug msg="error: Temporary error: ssh command error:\ncommand : timeout 5s oc get secret --context admin --cluster crc --kubeconfig /opt/kubeconfig\nerr : Process exited with status 1\n - sleeping 1s" level=debug msg="retry loop: attempt 24" level=debug msg="Running SSH command: timeout 5s oc get secret --context admin --cluster crc --kubeconfig /opt/kubeconfig" level=debug msg="SSH command results: err: Process exited with status 1, output: " level=debug msg="The connection to the server api.crc.testing:6443 was refused - did you specify the right host or port?\n" level=debug msg="error: Temporary error: ssh command error:\ncommand : timeout 5s oc get secret --context admin --cluster crc --kubeconfig /opt/kubeconfig\nerr : Process exited with status 1\n - sleeping 1s" level=debug msg="retry loop: attempt 25" level=debug msg="Running SSH command: timeout 5s oc get secret --context admin --cluster crc --kubeconfig /opt/kubeconfig" level=debug msg="SSH command results: err: Process exited with status 1, output: " level=debug msg="The connection to the server api.crc.testing:6443 was refused - did you specify the right host or port?\n" level=debug msg="error: Temporary error: ssh command error:\ncommand : timeout 5s oc get secret --context admin --cluster crc --kubeconfig /opt/kubeconfig\nerr : Process exited with status 1\n - sleeping 1s" level=debug msg="retry loop: attempt 26" level=debug msg="Running SSH command: timeout 5s oc get secret --context admin --cluster crc --kubeconfig /opt/kubeconfig" level=debug msg="SSH command results: err: Process exited with status 1, output: " level=debug msg="The connection to the server api.crc.testing:6443 was refused - did you specify the right host or port?\n" level=debug msg="error: Temporary error: ssh command error:\ncommand : timeout 5s oc get secret --context admin --cluster crc --kubeconfig /opt/kubeconfig\nerr : Process exited with status 1\n - sleeping 1s" level=debug msg="retry loop: attempt 27" level=debug msg="Running SSH command: timeout 5s oc get secret --context admin --cluster crc --kubeconfig /opt/kubeconfig" level=debug msg="SSH command results: err: Process exited with status 1, output: " level=debug msg="The connection to the server api.crc.testing:6443 was refused - did you specify the right host or port?\n" level=debug msg="error: Temporary error: ssh command error:\ncommand : timeout 5s oc get secret --context admin --cluster crc --kubeconfig /opt/kubeconfig\nerr : Process exited with status 1\n - sleeping 1s" level=debug msg="retry loop: attempt 28" level=debug msg="Running SSH command: timeout 5s oc get secret --context admin --cluster crc --kubeconfig /opt/kubeconfig" level=debug msg="SSH command results: err: Process exited with status 1, output: " level=debug msg="The connection to the server api.crc.testing:6443 was refused - did you specify the right host or port?\n" level=debug msg="error: Temporary error: ssh command error:\ncommand : timeout 5s oc get secret --context admin --cluster crc --kubeconfig /opt/kubeconfig\nerr : Process exited with status 1\n - sleeping 1s" level=debug msg="retry loop: attempt 29" level=debug msg="Running SSH command: timeout 5s oc get secret --context admin --cluster crc --kubeconfig /opt/kubeconfig" level=debug msg="SSH command results: err: Process exited with status 1, output: " level=debug msg="The connection to the server api.crc.testing:6443 was refused - did you specify the right host or port?\n" level=debug msg="error: Temporary error: ssh command error:\ncommand : timeout 5s oc get secret --context admin --cluster crc --kubeconfig /opt/kubeconfig\nerr : Process exited with status 1\n - sleeping 1s" level=debug msg="retry loop: attempt 30" level=debug msg="Running SSH command: timeout 5s oc get secret --context admin --cluster crc --kubeconfig /opt/kubeconfig" level=debug msg="SSH command results: err: Process exited with status 1, output: " level=debug msg="The connection to the server api.crc.testing:6443 was refused - did you specify the right host or port?\n" level=debug msg="error: Temporary error: ssh command error:\ncommand : timeout 5s oc get secret --context admin --cluster crc --kubeconfig /opt/kubeconfig\nerr : Process exited with status 1\n - sleeping 1s" level=debug msg="retry loop: attempt 31" level=debug msg="Running SSH command: timeout 5s oc get secret --context admin --cluster crc --kubeconfig /opt/kubeconfig" level=debug msg="SSH command results: err: Process exited with status 1, output: " level=debug msg="The connection to the server api.crc.testing:6443 was refused - did you specify the right host or port?\n" level=debug msg="error: Temporary error: ssh command error:\ncommand : timeout 5s oc get secret --context admin --cluster crc --kubeconfig /opt/kubeconfig\nerr : Process exited with status 1\n - sleeping 1s" level=debug msg="retry loop: attempt 32" level=debug msg="Running SSH command: timeout 5s oc get secret --context admin --cluster crc --kubeconfig /opt/kubeconfig" level=debug msg="SSH command results: err: Process exited with status 1, output: " level=debug msg="The connection to the server api.crc.testing:6443 was refused - did you specify the right host or port?\n" level=debug msg="error: Temporary
Integration.[It] Behind proxy wait for cluster in Running state [openshift-preset, goproxy]: Integration#L1
Unexpected error: <*errors.errorString | 0xc00005c3b0>: not found: running. Timeout { s: "not found: running. Timeout", } occurred
Integration.[BeforeSuite]: Integration#L1
Unexpected error: <*errors.errorString | 0xc0004681e0>: error starting crc cleanup: Command stdout: stderr: error: exec: "crc": executable file not found in %PATH% { s: "error starting crc cleanup:\nCommand stdout:\n\nstderr:\n\nerror:\nexec: \"crc\": executable file not found in %PATH%", } occurred
Integration.[It] Behind proxy wait for cluster in Running state [openshift-preset, goproxy]: Integration#L1
Unexpected error: <*errors.errorString | 0xc000631260>: not found: running. Timeout { s: "not found: running. Timeout", } occurred
Install new operator: Install new operator#L1
Step with up to "60" retries with wait period of "5s" command "oc get taskruns" output matches "echo-task-run(.*)Succeeded.*": output did not match. Expected: 'echo-task-run(.*)Succeeded.*', Actual: 'NAME SUCCEEDED REASON STARTTIME COMPLETIONTIME echo-task-run False PodCreationFailed 5m55s 5m43s'
Integration.[It] Behind proxy start CRC [openshift-preset, goproxy]: Integration#L1
Unexpected error: <cmd.CodeExitError>: error running C:\Program Files\Red Hat OpenShift Local\crc.exe start -p C:\Users\rhqp\crc-qe\pull-secret: Command stdout: stderr: level=debug msg="CRC version: 2.41.0+c17506\n" level=debug msg="OpenShift version: 4.16.7\n" level=debug msg="MicroShift version: 4.16.7\n" level=debug msg="Running 'crc start'" level=debug msg="Total memory of system is 34359267328 bytes" level=debug msg="No new version available. The latest version is 2.41.0" level=debug msg="Checking file: C:\\Users\\rhqp\\.crc\\machines\\crc\\.crc-exist" level=info msg="Using bundle path C:\\Users\\rhqp\\.crc\\cache\\crc_hyperv_4.16.7_amd64.crcbundle" level=info msg="Checking minimum RAM requirements" level=debug msg="Total memory of system is 34359267328 bytes" level=info msg="Check if Podman binary exists in: C:\\Users\\rhqp\\.crc\\bin\\oc" level=info msg="Checking if running in a shell with administrator rights" level=debug msg="Running '$currentPrincipal = New-Object Security.Principal.WindowsPrincipal([Security.Principal.WindowsIdentity]::GetCurrent());$currentPrincipal.IsInRole([Security.Principal.WindowsBuiltInRole]::Administrator)'" level=info msg="Checking Windows release" level=debug msg="Running '(Get-ItemProperty -Path \"HKLM:\\SOFTWARE\\Microsoft\\Windows NT\\CurrentVersion\" -Name ReleaseId).ReleaseId'" level=info msg="Checking Windows edition" level=debug msg="Running '(Get-ItemProperty -Path \"HKLM:\\SOFTWARE\\Microsoft\\Windows NT\\CurrentVersion\").EditionID'" level=debug msg="Running on Windows Enterprise edition" level=info msg="Checking if Hyper-V is installed and operational" level=debug msg="Running '@(Get-Wmiobject Win32_ComputerSystem).HypervisorPresent'" level=debug msg="Running '@(Get-Service vmms).Status'" level=info msg="Checking if Hyper-V service is enabled" level=debug msg="Running '@(Get-Service vmms).Status'" level=info msg="Checking if crc-users group exists" level=debug msg="Running 'Get-LocalGroup -Name crc-users'" level=info msg="Checking if current user is in crc-users and Hyper-V admins group" level=debug msg="Running '(Get-LocalGroupMember -Group 'crc-users').Name'" level=debug msg="Checking current user is in the 'crc-user' group" level=debug msg="group members: mapt0e06aaa8\\rhqp" level=debug msg="Running '(Get-LocalGroupMember -SID 'S-1-5-32-578').Name'" level=debug msg="Checking current user is in the 'Hyper-v Administrators' group" level=debug msg="group members: mapt0e06aaa8\\rhqp" level=info msg="Checking if vsock is correctly configured" level=debug msg="Running 'Get-Item -Path \"HKLM:\\SOFTWARE\\Microsoft\\Windows NT\\CurrentVersion\\Virtualization\\GuestCommunicationServices\\00000400-FACB-11E6-BD58-64006A7986D3\"'" level=info msg="Checking if the win32 background launcher is installed" level=debug msg="Running '(Get-Item 'C:\\Program Files\\Red Hat OpenShift Local\\crc-background-launcher.exe').VersionInfo.FileVersion'" level=debug msg="Found crc-background-launcher.exe version 0.0.0.1" level=info msg="Checking if the daemon task is installed" level=debug msg="Running 'Get-ScheduledTask -TaskName crcDaemon'" level=debug msg="Running '(Get-ScheduledTask -TaskName \"crcDaemon\").Version'" level=info msg="Checking if the daemon task is running" level=debug msg="Running '(Get-ScheduledTask -TaskName \"crcDaemon\").State'" level=info msg="Checking admin helper service is running" level=debug msg="Running '(Get-Service crcAdminHelper).Status'" level=info msg="Checking SSH port availability" level=debug msg="Checking file: C:\\Users\\rhqp\\.crc\\machines\\crc\\.crc-exist" level=debug msg="Copying 'C:\\Users\\rhqp\\.crc\\cache\\crc_hyperv_4.16.7_amd64\\oc.exe' to 'C:\\Users\\rhqp\\.crc\\bin\\oc\\oc.exe'" level=debug msg="Copying 'C:\\Users\\rhqp\\.crc\\cache\\crc_hyperv_4.16.7_amd64\\podman.exe' to 'C:\\Users\\rhqp\\.crc\\bin\\podman\\podman.exe'" level=info msg="Loading bundle: crc_hyperv_4.16.7_amd64..." level=debug msg="Using secret from configuration" level=info msg="Creating CRC VM for OpenShift 4.16.7..." level=debug msg="Running pre-create checks..." level=debug msg="Running '@(Get-Module -ListAvailable hyper-v).Name | Get-Unique'" level=debug msg="Running '@([Security.Principal.WindowsPrincipal][Security.Principal.WindowsIdentity]::GetCurrent()).IsInRole(([System.Security.Principal.SecurityIdentifier]::new(\"S-1-5-32-578\")))'" level=debug msg="Creating machine..." level=debug msg="Machine: libhvee -> creating: system settings" level=debug msg="Machine: libhvee -> creating: copy disk image" level=debug msg="Machine: libhvee -> creating: hardware setup" level=debug msg="Machine: libhvee -> creating: done" level=debug msg="C:\\Users\\rhqp\\.crc\\machines\\crc\\crc.vhdx is already 33285996544 bytes" level=info msg="Generating new SSH key pair..." level=info msg="Generating new password for the kubeadmin user" level=debug msg="Created C:\\Users\\rhqp\\.crc\\machines\\crc\\.crc-exist" level=debug msg="Machine successfully created" level=debug msg="Checking file: C:\\Users\\rhqp\\.crc\\machines\\crc\\.crc-exist" level=debug msg="Machine: libhvee -> state" level=debug msg="Machine: libhvee -> get machine" level=debug msg="Machine: libhvee -> state: get" level=debug msg="Machine: libhvee -> state: stopped" level=debug msg="Copying 'C:\\Users\\rhqp\\.crc\\cache\\crc_hyperv_4.16.7_amd64\\oc.exe' to 'C:\\Users\\rhqp\\.crc\\bin\\oc\\oc.exe'" level=debug msg="Copying 'C:\\Users\\rhqp\\.crc\\cache\\crc_hyperv_4.16.7_amd64\\podman.exe' to 'C:\\Users\\rhqp\\.crc\\bin\\podman\\podman.exe'" level=info msg="Starting CRC VM for openshift 4.16.7..." level=debug msg="Updating CRC VM configuration" level=debug msg="Machine: libhvee -> get machine" level=debug msg="Machine: libhvee -> start" level=debug msg="Waiting for machine to be running, this may take a few minutes..." level=debug msg="retry loop: attempt 0" level=debug msg="Machine: libhvee -> state" level=debug msg="Machine: libhvee -> get machine" level=debug msg="Machine: libhvee -> state: get" level=debug msg="Machine: libhvee -> state: running" level=debug msg="Machine is up and running!" level=debug msg="Machine: libhvee -> state" level=debug msg="Machine: libhvee -> get machine" level=debug msg="Machine: libhvee -> state: get" level=debug msg="Machine: libhvee -> state: running" level=info msg="CRC instance is running with IP 127.0.0.1" level=debug msg="Waiting until ssh is available" level=debug msg="retry loop: attempt 0" level=debug msg="Running SSH command: exit 0" level=debug msg="Using ssh private keys: [C:\\Users\\rhqp\\.crc\\machines\\crc\\id_ed25519 C:\\Users\\rhqp\\.crc\\cache\\crc_hyperv_4.16.7_amd64\\id_ecdsa_crc]" level=debug msg="SSH command results: err: ssh: handshake failed: read tcp 127.0.0.1:54867->127.0.0.1:2222: wsarecv: An existing connection was forcibly closed by the remote host., output: " level=debug msg="error: Temporary error: ssh command error:\ncommand : exit 0\nerr : ssh: handshake failed: read tcp 127.0.0.1:54867->127.0.0.1:2222: wsarecv: An existing connection was forcibly closed by the remote host.\n - sleeping 1s" level=debug msg="retry loop: attempt 1" level=debug msg="Running SSH command: exit 0" level=debug msg="Using ssh private keys: [C:\\Users\\rhqp\\.crc\\machines\\crc\\id_ed25519 C:\\Users\\rhqp\\.crc\\cache\\crc_hyperv_4.16.7_amd64\\id_ecdsa_crc]" level=debug msg="SSH command results: err: ssh: handshake failed: read tcp 127.0.0.1:54868->127.0.0.1:2222: wsarecv: An existing connection was forcibly closed by the remote host., output: " level=debug msg="error: Temporary error: ssh command error:\ncommand : exit 0\nerr : ssh: handshake failed: read tcp 127.0.0.1:54868->127.0.0.1:2222: wsarecv: An existing connection was forcibly closed by the remote host.\n - sleeping 1s" level=debug msg="retry loop: attempt 2" level=debug msg="Running SSH command: exit 0" level=debug msg="Using ssh private keys: [C:\\Users\\rhqp\\.crc\\machines\\crc\\id_ed25519 C:\\Users\\rhqp\\.crc\\cache\\crc_hyperv_4.16.7_amd64\\id_ecdsa_crc]" level=debug msg="SSH command results: err: <nil>, output: " level=info msg="CRC VM is running" level=debug msg="Using root access: disable core user password" level=debug msg="Running SSH command: sudo passwd --lock core" level=debug msg="SSH command results: err: <nil>, output: Locking password for user core.\npasswd: Success\n" level=debug msg="Running SSH command: cat /home/core/.ssh/authorized_keys" level=debug msg="SSH command results: err: Process exited with status 1, output: " level=info msg="Updating authorized keys..." level=debug msg="Creating /home/core/.ssh/authorized_keys with permissions 0644 in the CRC VM" level=debug msg="Running SSH command: <hidden>" level=debug msg="SSH command succeeded" level=debug msg="Running SSH command: rm /home/core/.ssh/authorized_keys.d/ignition" level=debug msg="SSH command results: err: <nil>, output: " level=debug msg="Using root access: Get device id" level=debug msg="Running SSH command: sudo /usr/sbin/blkid -t TYPE=xfs -o device" level=debug msg="SSH command results: err: <nil>, output: /dev/sda4\n" level=debug msg="Using root access: Growing /dev/sda4 partition" level=debug msg="Running SSH command: sudo /usr/bin/growpart /dev/sda 4" level=debug msg="SSH command results: err: Process exited with status 1, output: NOCHANGE: partition 4 is size 63961055. it cannot be grown\n" level=debug msg="No free space after /dev/sda4, nothing to do" level=debug msg="Using root access: make root Podman socket accessible" level=debug msg="Running SSH command: sudo chmod 777 /run/podman/ /run/podman/podman.sock" level=debug msg="SSH command results: err: <nil>, output: " level=debug msg="Running SSH command: systemctl status ovs-configuration.service" level=debug msg="SSH command results: err: Process exited with status 3, output: ○ ovs-configuration.service - Configures OVS with proper host networking configuration\n Loaded: loaded (/etc/systemd/system/ovs-configuration.service; enabled; preset: disabled)\n Active: inactive (dead)\n" level=debug msg="Using root access: Executing systemctl daemon-reload command" level=debug msg="Running SSH command: sudo systemctl daemon-reload" level=debug msg="SSH command results: err: <nil>, output: " level=debug msg="Using root access: Executing systemctl start ovs-configuration.service" level=debug msg="Running SSH command: sudo systemctl start ovs-configuration.service" level=debug msg="SSH command results: err: <nil>, output: " level=debug msg="Using root access: Update resolv.conf file" level=debug msg="Running SSH command: sudo nmcli con modify --temporary ovs-if-br-ex ipv4.dns 192.168.127.1 ipv4.dns-search crc.testing" level=debug msg="SSH command results: err: <nil>, output: " level=debug msg="Using root access: Executing systemctl daemon-reload command" level=debug msg="Running SSH command: sudo systemctl daemon-reload" level=debug msg="SSH command results: err: <nil>, output: " level=debug msg="Using root access: Executing systemctl restart NetworkManager.service" level=debug msg="Running SSH command: sudo systemctl restart NetworkManager.service" level=debug msg="SSH command results: err: <nil>, output: " level=debug msg="retry loop: attempt 0" level=debug msg="Running SSH command: host -R 3 foo.apps-crc.testing" level=debug msg="SSH command results: err: <nil>, output: foo.apps-crc.testing has address 192.168.127.2\n" level=info msg="Check internal and public DNS query..." level=debug msg="Running SSH command: curl --head quay.io --proxy http://127.0.0.1:8888 --noproxy 127.0.0.1,localhost,.testing --insecure --proxy-insecure" level=debug msg="SSH command results: err: Process exited with status 7, output: " level=warning msg="Failed public DNS query from the cluster: ssh command error:\ncommand : curl --head quay.io --proxy http://127.0.0.1:8888 --noproxy 127.0.0.1,localhost,.testing --insecure --proxy-insecure\nerr : Process exited with status 7\n : " level=info msg="Check DNS query from host..." level=debug msg="api.crc.testing resolved to [127.0.0.1]" level=info msg="Verifying validity of the kubelet certificates..." level=debug msg="Running SSH command: date --date=\"$(sudo openssl x509 -in /var/lib/kubelet/pki/kubelet-client-current.pem -noout -enddate | cut -d= -f 2)\" --iso-8601=seconds" level=debug msg="SSH command results: err: <nil>, output: 2025-08-20T06:19:22+00:00\n" level=debug msg="Running SSH command: date --date=\"$(sudo openssl x509 -in /var/lib/kubelet/pki/kubelet-server-current.pem -noout -enddate | cut -d= -f 2)\" --iso-8601=seconds" level=debug msg="SSH command results: err: <nil>, output: 2025-08-20T06:20:43+00:00\n" level=debug msg="Running SSH command: date --date=\"$(sudo openssl x509 -in /etc/kubernetes/static-pod-resources/kube-apiserver-certs/secrets/aggregator-client/tls.crt -noout -enddate | cut -d= -f 2)\" --iso-8601=seconds" level=debug msg="SSH command results: err: <nil>, output: 2025-08-20T06:21:53+00:00\n" level=info msg="Starting kubelet service" level=debug msg="Using root access: Executing systemctl daemon-reload command" level=debug msg="Running SSH command: sudo systemctl daemon-reload" level=debug msg="SSH command results: err: <nil>, output: " level=debug msg="Using root access: Executing systemctl start kubelet" level=debug msg="Running SSH command: sudo systemctl start kubelet" level=debug msg="SSH command results: err: <nil>, output: " level=info msg="Waiting for kube-apiserver availability... [takes around 2min]" level=debug msg="retry loop: attempt 0" level=debug msg="Running SSH command: timeout 5s oc get nodes --context admin --cluster crc --kubeconfig /opt/kubeconfig" level=debug msg="SSH command results: err: Process exited with status 1, output: " level=debug msg="E0920 12:28:29.391653 3685 memcache.go:265] couldn't get current server API group list: Get \"https://api.crc.testing:6443/api?timeout=32s\": dial tcp 192.168.127.2:6443: connect: connection refused\nE0920 12:28:29.392688 3685 memcache.go:265] couldn't get current server API group list: Get \"https://api.crc.testing:6443/api?timeout=32s\": dial tcp 192.168.127.2:6443: connect: connection refused\nE0920 12:28:29.393818 3685 memcache.go:265] couldn't get current server API group list: Get \"https://api.crc.testing:6443/api?timeout=32s\": dial tcp 192.168.127.2:6443: connect: connection refused\nE0920 12:28:29.395131 3685 memcache.go:265] couldn't get current server API group list: Get \"https://api.crc.testing:6443/api?timeout=32s\": dial tcp 192.168.127.2:6443: connect: connection refused\nE0920 12:28:29.396386 3685 memcache.go:265] couldn't get current server API group list: Get \"https://api.crc.testing:6443/api?timeout=32s\": dial tcp 192.168.127.2:6443: connect: connection refused\nThe connection to the server api.crc.testing:6443 was refused - did you specify the right host or port?\n" level=debug msg="error: Temporary error: ssh command error:\ncommand : timeout 5s oc get nodes --context admin --cluster crc --kubeconfig /opt/kubeconfig\nerr : Process exited with status 1\n - sleeping 1s" level=debug msg="retry loop: attempt 1" level=debug msg="Running SSH command: timeout 5s oc get nodes --context admin --cluster crc --kubeconfig /opt/kubeconfig" level=debug msg="SSH command results: err: Process exited with status 1, output: " level=debug msg="E0920 12:28:30.627460 4302 memcache.go:265] couldn't get current server API group list: Get \"https://api.crc.testing:6443/api?timeout=32s\": dial tcp 192.168.127.2:6443: connect: connection refused\nE0920 12:28:30.630604 4302 memcache.go:265] couldn't get current server API group list: Get \"https://api.crc.testing:6443/api?timeout=32s\": dial tcp 192.168.127.2:6443: connect: connection refused\nE0920 12:28:30.631801 4302 memcache.go:265] couldn't get current server API group list: Get \"https://api.crc.testing:6443/api?timeout=32s\": dial tcp 192.168.127.2:6443: connect: connection refused\nE0920 12:28:30.632937 4302 memcache.go:265] couldn't get current server API group list: Get \"https://api.crc.testing:6443/api?timeout=32s\": dial tcp 192.168.127.2:6443: connect: connection refused\nE0920 12:28:30.633856 4302 memcache.go:265] couldn't get current server API group list: Get \"https://api.crc.testing:6443/api?timeout=32s\": dial tcp 192.168.127.2:6443: connect: connection refused\nThe connection to the server api.crc.testing:6443 was refused - did you specify the right host or port?\n" level=debug msg="error: Temporary error: ssh command error:\ncommand : timeout 5s oc get nodes --context admin --cluster crc --kubeconfig /opt/kubeconfig\nerr : Process exited with status 1\n - sleeping 1s" level=debug msg="retry loop: attempt 2" level=debug msg="Running SSH command: timeout 5s oc get nodes --context admin --cluster crc --kubeconfig /opt/kubeconfig" level=debug msg="SSH command results: err: Process exited with status 124, output: " level=debug level=debug msg="error: Temporary error: ssh command error:\ncommand : timeout 5s oc get nodes --context admin --cluster crc --kubeconfig /opt/kubeconfig\nerr : Process exited with status 124\n - sleeping 1s" level=debug msg="retry loop: attempt 3" level=debug msg="Running SSH command: timeout 5s oc get nodes --context admin --cluster crc --kubeconfig /opt/kubeconfig" level=debug msg="SSH command results: err: Process exited with status 124, output: " level=debug level=debug msg="error: Temporary error: ssh command error:\ncommand : timeout 5s oc get nodes --context admin --cluster crc --kubeconfig /opt/kubeconfig\nerr : Process exited with status 124\n - sleeping 1s" level=debug msg="retry loop: attempt 4" level=debug msg="Running SSH command: timeout 5s oc get nodes --context admin --cluster crc --kubeconfig /opt/kubeconfig" level=debug msg="SSH command results: err: <nil>, output: NAME STATUS ROLES AGE VERSION\ncrc NotReady control-plane,master,worker 32d v1.29.7+6abe8a1\n" level=debug msg="NAME STATUS ROLES AGE VERSION\ncrc NotReady control-plane,master,worker 32d v1.29.7+6abe8a1\n" level=info msg="Adding proxy configuration to the cluster..." level=debug msg="Waiting for availability of resource type 'proxy'" level=debug msg="retry loop: attempt 0" level=debug msg="Running SSH command: timeout 5s oc get proxy --context admin --cluster crc --kubeconfig /opt/kubeconfig" level=debug msg="SSH command results: err: <nil>, output: NAME AGE\ncluster 32d\n" level=debug msg="NAME AGE\ncluster 32d\n" level=debug msg="Adding proxy CA cert to cluster" level=debug msg="Creating /tmp/user-ca-bundle.json with permissions 0644 in the CRC VM" level=debug msg="Running SSH command: <hidden>" level=debug msg="SSH command succeeded" level=debug msg="Running SSH command: <hidden>" level=debug msg="SSH command succeeded" level=debug msg="Patch string {\"spec\":{\"httpProxy\":\"http://127.0.0.1:8888\",\"httpsProxy\":\"http://127.0.0.1:8888\",\"noProxy\":\"127.0.0.1,localhost,.testing,.testing,127.0.0.1\",\"trustedCA\":{\"name\":\"user-ca-bundle\"}}}" level=debug msg="Running SSH command: <hidden>" level=debug msg="SSH command succeeded" level=debug msg="Waiting for availability of resource type 'configmap'" level=debug msg="retry loop: attempt 0" level=debug msg="Running SSH command: timeout 5s oc get configmap --context admin --cluster crc --kubeconfig /opt/kubeconfig" level=debug msg="SSH command results: err: <nil>, output: NAME DATA AGE\nkube-root-ca.crt 1 32d\nopenshift-service-ca.crt 1 32d\n" level=debug msg="NAME DATA AGE\nkube-root-ca.crt 1 32d\nopenshift-service-ca.crt 1 32d\n" level=debug msg="Running SSH command: timeout 30s oc delete -n openshift-machine-config-operator configmap machine-config-controller --context admin --cluster crc --kubeconfig /opt/kubeconfig" level=debug msg="SSH command results: err: Process exited with status 1, output: " level=debug msg="Waiting for availability of resource type 'lease'" level=debug msg="retry loop: attempt 0" level=debug msg="Running SSH command: timeout 5s oc get lease --context admin --cluster crc --kubeconfig /opt/kubeconfig" level=debug msg="SSH command results: err: <nil>, output: " level=debug level=debug msg="Running SSH command: timeout 30s oc delete -A lease --all --context admin --cluster crc --kubeconfig /opt/kubeconfig" level=debug msg="SSH command results: err: <nil>, output: lease.coordination.k8s.io \"crc\" deleted\nlease.coordination.k8s.io \"apiserver-yz2phfmetulqy4pemhbirhdnii\" deleted\nlease.coordination.k8s.io \"cluster-policy-controller-lock\" deleted\nlease.coordination.k8s.io \"kube-controller-manager\" deleted\nlease.coordination.k8s.io \"kube-scheduler\" deleted\nlease.coordination.k8s.io \"openshift-apiserver-operator-lock\" deleted\nlease.coordination.k8s.io \"cluster-authentication-operator-lock\" deleted\nlease.coordination.k8s.io \"cluster-machine-approver-leader\" deleted\nlease.coordination.k8s.io \"version\" deleted\nlease.coordination.k8s.io \"config-operator-lock\" deleted\nlease.coordination.k8s.io \"console-operator-lock\" deleted\nlease.coordination.k8s.io \"openshift-controller-manager-operator-lock\" deleted\nlease.coordination.k8s.io \"openshift-master-controllers\" deleted\nlease.coordination.k8s.io \"openshift-cluster-etcd-operator-lock\" deleted\nlease.coordination.k8s.io \"openshift-master-controllers\" deleted\nlease.coordination.k8s.io \"kube-apiserver-operator-lock\" deleted\nlease.coordination.k8s.io \"cert-regeneration-controller-lock\" deleted\nlease.coordination.k8s.io \"kube-controller-manager-operator-lock\" deleted\nlease.coordination.k8s.io \"cert-recovery-controller-lock\" deleted\nlease.coordination.k8s.io \"cluster-policy-controller-lock\" deleted\nlease.coordination.k8s.io \"openshift-cluster-kube-scheduler-operator-lock\" deleted\nlease.coordination.k8s.io \"cert-recovery-controller-lock\" deleted\nlease.coordination.k8s.io \"kube-scheduler\" deleted\nlease.coordination.k8s.io \"openshift-kube-storage-version-migrator-operator-lock\" deleted\nlease.coordination.k8s.io \"control-plane-machine-set-leader\" deleted\nlease.coordination.k8s.io \"machine-api-operator\" deleted\nlease.coordination.k8s.io \"machine-config\" deleted\nlease.coordination.k8s.io \"machine-config-controller\" deleted\nlease.coordination.k8s.io \"marketplace-operator-lock\" deleted\nlease.coordination.k8s.io \"ovnkube-identity\" deleted\nlease.coordination.k8s.io \"network-operator-lock\" deleted\nlease.coordination.k8s.io \"packageserver-controller-lock\" deleted\nlease.coordination.k8s.io \"ovn-kubernetes-master\" deleted\nlease.coordination.k8s.io \"openshift-route-controllers\" deleted\nlease.coordination.k8s.io \"service-ca-operator-lock\" deleted\nlease.coordination.k8s.io \"service-ca-controller-lock\" deleted\n" level=debug msg="Waiting for availability of resource type 'secret'" level=debug msg="retry loop: attempt 0" level=debug msg="Running SSH command: timeout 5s oc get secret --context admin --cluster crc --kubeconfig /opt/kubeconfig" level=debug msg="SSH command results: err: <nil>, output: NAME TYPE DATA AGE\nbuilder-dockercfg-5gn6x kubernetes.io/dockercfg 1 31d\ndefault-dockercfg-5mnnm kubernetes.io/dockercfg 1 31d\ndeployer-dockercfg-psgvx kubernetes.io/dockercfg 1 31d\n" level=debug msg="NAME TYPE DATA AGE\nbuilder-dockercfg-5gn6x kubernetes.io/dockercfg 1 31d\ndefault-dockercfg-5mnnm kubernetes.io/dockercfg 1 31d\ndeployer-dockercfg-psgvx kubernetes.io/dockercfg 1 31d\n" level=debug msg="Running SSH command: <hidden>" level=debug msg="SSH command succeeded" level=info msg="Adding user's pull secret to the cluster..." level=debug msg="Running SSH command: <hidden>" level=debug msg="SSH command succeeded" level=debug msg="Waiting for availability of resource type 'machineconfigs'" level=debug msg="retry loop: attempt 0" level=debug msg="Running SSH command: timeout 5s oc get machineconfigs --context admin --cluster crc --kubeconfig /opt/kubeconfig" level=debug msg="SSH command results: err: <nil>, output: NAME GENERATEDBYCONTROLLER IGNITIONVERSION AGE\n00-master 64434515dba546949bcec20be26f3215a4fc5b53 3.4.0 32d\n00-worker 64434515dba546949bcec20be26f3215a4fc5b53 3.4.0 32d\n01-master-container-runtime 64434515dba546949bcec20be26f3215a4fc5b53 3.4.0 32d\n01-master-kubelet 64434515dba546949bcec20be26f3215a4fc5b53 3.4.0 32d\n01-worker-container-runtime 64434515dba546949bcec20be26f3215a4fc5b53 3.4.0 32d\n01-worker-kubelet 64434515dba546949bcec20be26f3215a4fc5b53 3.4.0 32d\n97-master-generated-kubelet 64434515dba546949bcec20be26f3215a4fc5b53 3.4.0 32d\n97-worker-generated-kubelet 64434515dba546949bcec20be26f3215a4fc5b53 3.4.0 32d\n98-master-generated-kubelet 64434515dba546949bcec20be26f3215a4fc5b53 3.4.0 32d\n98-worker-generated-kubelet 64434515dba546949bcec20be26f3215a4fc5b53 3.4.0 32d\n99-master-generated-registries 64434515dba546949bcec20be26f3215a4fc5b53 3.4.0 32d\n99-master-ssh 3.2.0 32d\n99-node-sizing-for-crc 3.2.0 32d\n99-openshift-machineconfig-master-dummy-networks 3.2.0 32d\n99-worker-generated-registries 64434515dba546949bcec20be26f3215a4fc5b53 3.4.0 32d\n99-worker-ssh 3.2.0 32d\nrendered-master-af3c83ca74c63b4b8a3a3381b9851b1f 64434515dba546949bcec20be26f3215a4fc5b53 3.4.0 31d\nrendered-worker-b45d4d2f8d21449c9543a709a1728281 64434515dba546949bcec20be26f3215a4fc5b53 3.4.0 31d\n" level=debug msg="NAME GENERATEDBYCONTROLLER IGNITIONVERSION AGE\n00-master 64434515dba546949bcec20be26f3215a4fc5b53 3.4.0 32d\n00-worker 64434515dba546949bcec20be26f3215a4fc5b53 3.4.0 32d\n01-master-container-runtime 64434515dba546949bcec20be26f3215a4fc5b53 3.4.0 32d\n01-master-kubelet 64434515dba546949bcec20be26f3215a4fc5b53 3.4.0 32d\n01-worker-container-runtime 64434515dba546949bcec20be26f3215a4fc5b53 3.4.0 32d\n01-worker-kubelet 64434515dba546949bcec20be26f3215a4fc5b53 3.4.0 32d\n97-master-generated-kubelet 64434515dba546949bcec20be26f3215a4fc5b53 3.4.0 32d\n97-worker-generated-kubelet 64434515dba546949bcec20be26f3215a4fc5b53 3.4.0 32d\n98-master-generated-kubelet 64434515dba546949bcec20be26f3215a4fc5b53 3.4.0 32d\n98-worker-generated-kubelet 64434515dba546949bcec20be26f3215a4fc5b53 3.4.0 32d\n99-master-generated-registries 64434515dba546949bcec20be26f3215a4fc5b53 3.4.0 32d\n99-master-ssh 3.2.0 32d\n99-node-sizing-for-crc 3.2.0 32d\n99-openshift-machineconfig-master-dummy-networks 3.2.0 32d\n99-worker-generated-registries 64434515dba546949bcec20be26f3215a4fc5b53 3.4.0 32d\n99-worker-ssh 3.2.0 32d\nrendered-master-af3c83ca74c63b4b8a3a3381b9851b1f 64434515dba546949bcec20be26f3215a4fc5b53 3.4.0 31d\nrendered-worker-b45d4d2f8d21449c9543a709a1728281 64434515dba546949bcec20be26f3215a4fc5b53 3.4.0 31d\n" level=debug msg="Running SSH command: timeout 30s oc get machineconfigs 99-master-ssh -o jsonpath='{.spec.config.passwd.users[0].sshAuthorizedKeys[0]}' --context admin --cluster crc --kubeconfig /opt/kubeconfig" level=debug msg="SSH command results: err: <nil>, output: ecdsa-sha2-nistp521 AAAAE2VjZHNhLXNoYTItbmlzdHA1MjEAAAAIbmlzdHA1MjEAAACFBAGo7QohLVAqqGVvlr9xGFnS/8At93YOTDqpDi05eyDxzpFgZSc5nqWFPrCv70ubLDd1qAwPir3JUEbs+F0kotqPdwE+4vItHSCzZ62kDhYSPZ7e3R+WmobL6/yfelSEG0JPm9ICmINYYoYKsTu515DedwVGj2Z6m943Kp3o+odLkewMlw== core" level=info msg="Updating SSH key to machine config resource..." level=debug msg="Running SSH command: timeout 30s oc patch machineconfig 99-master-ssh -p '{\"spec\": {\"config\": {\"passwd\": {\"users\": [{\"name\": \"core\", \"sshAuthorizedKeys\": [\"ssh-ed25519 AAAAC3NzaC1lZDI1NTE5AAAAIBpwJuMDmnEVWKvwr/G6PcM0ej8fEwg/yUs2YZj4hqJ8\"]}]}}}}' --type merge --context admin --cluster crc --kubeconfig /opt/kubeconfig" level=debug msg="SSH command results: err: <nil>, output: machineconfig.machineconfiguration.openshift.io/99-master-ssh patched\n" level=info msg="Waiting until the user's pull secret is written to the instance disk..." level=debug msg="retry loop: attempt 0" level=debug msg="Running SSH command: <hidden>" level=debug msg="SSH command succeeded" level=debug msg="error: Temporary error: pull secret not updated to disk - sleeping 2s" level=debug msg="retry loop: attempt 1" level=debug msg="Running SSH command: <hidden>" level=debug msg="SSH command succeeded" level=debug msg="error: Temporary error: pull secret not updated to disk - sleeping 2s" level=debug msg="retry loop: attempt 2" level=debug msg="Running SSH command: <hidden>" level=debug msg="SSH command succeeded" level=debug msg="error: Temporary error: pull secret not updated to disk - sleeping 2s" level=debug msg="retry loop: attempt 3" level=debug msg="Running SSH command: <hidden>" level=debug msg="SSH command succeeded" level=debug msg="error: Temporary error: pull secret not updated to disk - sleeping 2s" level=debug msg="retry loop: attempt 4" level=debug msg="Running SSH command: <hidden>" level=debug msg="SSH command succeeded" level=debug msg="error: Temporary error: pull secret not updated to disk - sleeping 2s" level=debug msg="retry loop: attempt 5" level=debug msg="Running SSH command: <hidden>" level=debug msg="SSH command succeeded" level=debug msg="error: Temporary error: pull secret not updated to disk - sleeping 2s" level=debug msg="retry loop: attempt 6" level=debug msg="Running SSH command: <hidden>" level=debug msg="SSH command succeeded" level=debug msg="error: Temporary error: pull secret not updated to disk - sleeping 2s" level=debug msg="retry loop: attempt 7" level=debug msg="Running SSH command: <hidden>" level=debug msg="SSH command succeeded" level=debug msg="error: Temporary error: pull secret not updated to disk - sleeping 2s" level=debug msg="retry loop: attempt 8" level=debug msg="Running SSH command: <hidden>" level=debug msg="SSH command succeeded" level=debug msg="error: Temporary error: pull secret not updated to disk - sleeping 2s" level=debug msg="retry loop: attempt 9" level=debug msg="Running SSH command: <hidden>" level=debug msg="SSH command succeeded" level=debug msg="error: Temporary error: pull secret not updated to disk - sleeping 2s" level=debug msg="retry loop: attempt 10" level=debug msg="Running SSH command: <hidden>" level=debug msg="SSH command succeeded" level=debug msg="error: Temporary error: pull secret not updated to disk - sleeping 2s" level=debug msg="retry loop: attempt 11" level=debug msg="Running SSH command: <hidden>" level=debug msg="SSH command succeeded" level=debug msg="error: Temporary error: pull secret not updated to disk - sleeping 2s" level=debug msg="retry loop: attempt 12" level=debug msg="Running SSH command: <hidden>" level=debug msg="SSH command succeeded" level=debug msg="error: Temporary error: pull secret not updated to disk - sleeping 2s" level=debug msg="retry loop: attempt 13" level=debug msg="Running SSH command: <hidden>" level=debug msg="SSH command succeeded" level=debug msg="error: Temporary error: pull secret not updated to disk - sleeping 2s" level=debug msg="retry loop: attempt 14" level=debug msg="Running SSH command: <hidden>" level=debug msg="SSH command succeeded" level=debug msg="error: Temporary error: pull secret not updated to disk - sleeping 2s" level=debug msg="retry loop: attempt 15" level=debug msg="Running SSH command: <hidden>" level=debug msg="SSH command succeeded" level=debug msg="error: Temporary error: pull secret not updated to disk - sleeping 2s" level=debug msg="retry loop: attempt 16" level=debug msg="Running SSH command: <hidden>" level=debug msg="SSH command succeeded" level=debug msg="error: Temporary error: pull secret not updated to disk - sleeping 2s" level=debug msg="retry loop: attempt 17" level=debug msg="Running SSH command: <hidden>" level=debug msg="SSH command succeeded" level=debug msg="error: Temporary error: pull secret not updated to disk - sleeping 2s" level=debug msg="retry loop: attempt 18" level=debug msg="Running SSH command: <hidden>" level=debug msg="SSH command succeeded" level=debug msg="error: Temporary error: pull secret not updated to disk - sleeping 2s" level=debug msg="retry loop: attempt 19" level=debug msg="Running SSH command: <hidden>" level=debug msg="SSH command succeeded" level=debug msg="error: Temporary error: pull secret not updated to disk - sleeping 2s" level=debug msg="retry loop: attempt 20" level=debug msg="Running SSH command: <hidden>" level=debug msg="SSH command succeeded" level=debug msg="error: Temporary error: pull secret not updated to disk - sleeping 2s" level=debug msg="retry loop: attempt 21" level=debug msg="Running SSH command: <hidden>" level=debug msg="SSH command succeeded" level=debug msg="error: Temporary error: pull secret not updated to disk - sleeping 2s" level=debug msg="retry loop: attempt 22" level=debug msg="Running SSH command: <hidden>" level=debug msg="SSH command succeeded" level=debug msg="error: Temporary error: pull secret not updated to disk - sleeping 2s" level=debug msg="retry loop: attempt 23" level=debug msg="Running SSH command: <hidden>" level=debug msg="SSH command succeeded" level=debug msg="error: Temporary error: pull secret not updated to disk - sleeping 2s" level=debug msg="retry loop: attempt 24" level=debug msg="Running SSH command: <hidden>" level=debug msg="SSH command succeeded" level=debug msg="error: Temporary error: pull secret not updated to disk - sleeping 2s" level=debug msg="retry loop: attempt 25" level=debug msg="Running SSH command: <hidden>" level=debug msg="SSH command succeeded" level=debug msg="error: Temporary error: pull secret not updated to disk - sleeping 2s" level=debug msg="retry loop: attempt 26" level=debug msg="Running SSH command: <hidden>" level=debug msg="SSH command succeeded" level=debug msg="error: Temporary error: pull secret not updated to disk - sleeping 2s" level=debug msg="retry loop: attempt 27" level=debug msg="Running SSH command: <hidden>" level=debug msg="SSH command succeeded" level=debug msg="error: Temporary error: pull secret not updated to disk - sleeping 2s" level=debug msg="retry loop: attempt 28" level=debug msg="Running SSH command: <hidden>" level=debug msg="SSH command succeeded" level=debug msg="error: Temporary error: pull secret not updated to disk - sleeping 2s" level=debug msg="retry loop: attempt 29" level=debug msg="Running SSH command: <hidden>" level=debug msg="SSH command succeeded" level=debug msg="error: Temporary error: pull secret not updated to disk - sleeping 2s" level=debug msg="retry loop: attempt 30" level=debug msg="Running SSH command: <hidden>" level=debug msg="SSH command succeeded" level=debug msg="error: Temporary error: pull secret not updated to disk - sleeping 2s" level=debug msg="retry loop: attempt 31" level=debug msg="Running SSH command: <hidden>" level=debug msg="SSH command succeeded" level=debug msg="error: Temporary error: pull secret not updated to disk - sleeping 2s" level=debug msg="retry loop: attempt 32" level=debug msg="Running SSH command: <hidden>" level=debug msg="SSH command succeeded" level=debug msg="error: Temporary error: pull secret not updated to disk - sleeping 2s" level=debug msg="retry loop: attempt 33" level=debug msg="Running SSH command: <hidden>" level=debug msg="SSH command succeeded" level=debug msg="error: Temporary error: pull secret not updated to disk - sleeping 2s" level=debug msg="retry loop: attempt 34" level=debug msg="Running SSH command: <hidden>" level=debug msg="SSH command succeeded" level=debug msg="error: Temporary error: pull secret not updated to disk - sleeping 2s" level=debug msg="retry loop: attempt 35" level=debug msg="Running SSH command: <hidden>" level=debug msg="SSH command succeeded" level=debug msg="error: Temporary error: pull secret not updated to disk - sleeping 2s" level=debug msg="retry loop: attempt 36" level=debug msg="Running SSH command: <hidden>" level=debug msg="SSH command succeeded" level=debug msg="error: Temporary error: pull secret not updated to disk - sleeping 2s" level=debug msg="retry loop: attempt 37" level=debug msg="Running SSH command: <hidden>" level=debug msg="SSH command succeeded" level=debug msg="error: Temporary error: pull secret not updated to disk - sleeping 2s" level=debug msg="retry loop: attempt 38" level=debug msg="Running SSH command: <hidden>" level=debug msg="SSH command succeeded" level=debug msg="error: Temporary error: pull secret not updated to disk - sleeping 2s" level=debug msg="retry loop: attempt 39" level=debug msg="Running SSH command: <hidden>" level=debug msg="SSH command succeeded" level=debug msg="error: Temporary error: pull secret not updated to disk - sleeping 2s" level=debug msg="retry loop: attempt 40" level=debug msg="Running SSH command: <hidden>" level=debug msg="SSH command succeeded" level=debug msg="error: Temporary error: pull secret not updated to disk - sleeping 2s" level=debug msg="retry loop: attempt 41" level=debug msg="Running SSH command: <hidden>" level=debug msg="SSH command succeeded" level=debug msg="error: Temporary error: pull secret not updated to disk - sleeping 2s" level=debug msg="retry loop: attempt 42" level=debug msg="Running SSH command: <hidden>" level=debug msg="SSH command succeeded" level=debug msg="error: Temporary error: pull secret not updated to disk - sleeping 2s" level=debug msg="retry loop: attempt 43" level=debug msg="Running SSH command: <hidden>" level=debug msg="SSH command succeeded" level=debug msg="error: Temporary error: pull secret not updated to disk - sleeping 2s" level=debug msg="retry loop: attempt 44" level=debug msg="Running SSH command: <hidden>" level=debug msg="SSH command succeeded" level=debug msg="error: Temporary error: pull secret not updated to disk - sleeping 2s" level=debug msg="retry loop: attempt 45" level=debug msg="Running SSH command: <hidden>" level=debug msg="SSH command succeeded" level=debug msg="error: Temporary error: pull secret not updated to disk - sleeping 2s" level=debug msg="retry loop: attempt 46" level=debug msg="Running SSH command: <hidden>" level=debug msg="SSH command succeeded" level=debug msg="error: Temporary error: pull secret not updated to disk - sleeping 2s" level=debug msg="retry loop: attempt 47" level=debug msg="Running SSH command: <hidden>" level=debug msg="SSH command succeeded" level=debug msg="error: Temporary error: pull secret not updated to disk - sleeping 2s" level=debug msg="retry loop: attempt 48" level=debug msg="Running SSH command: <hidden>" level=debug msg="SSH command succeeded" level=debug msg="error: Temporary error: pull secret not updated to disk - sleeping 2s" level=debug msg="retry loop: attempt 49" level=debug msg="Running SSH command: <hidden>" level=debug msg="SSH command succeeded" level=debug msg="error: Temporary error: pull secret not updated to disk - sleeping 2s" level=debug msg="retry loop: attempt 50" level=debug msg="Running SSH command: <hidden>" level=debug msg="SSH command succeeded" level=debug msg="error: Temporary error: pull secret not updated to disk - sleeping 2s" level=debug msg="retry loop: attempt 51" level=debug msg="Running SSH command: <hidden>" level=debug msg="SSH command succeeded" level=debug msg="error: Temporary error: pull secret not updated to disk - sleeping 2s" level=debug msg="retry loop: attempt 52" level=debug msg="Running SSH command: <hidden>" level=debug msg="SSH command succeeded" level=debug msg="error: Temporary error: pull secret not updated to disk - sleeping 2s" level=debug msg="retry loop: attempt 53" level=debug msg="Running SSH command: <hidden>" level=debug msg="SSH command succeeded" level=debug msg="error: Temporary error: pull secret not updated to disk - sleeping 2s" level=debug msg="retry loop: attempt 54" level=debug msg="Running SSH command: <hidden>" level=debug msg="SSH command succeeded" level=debug msg="error: Temporary error: pull secret not updated to disk - sleeping 2s" level=debug msg="retry loop: attempt 55" level=debug msg="Running SSH command: <hidden>" level=debug msg="SSH command succeeded" level=debug msg="error: Temporary error: pull secret not updated to disk - sleeping 2s" level=debug msg="retry loop: attempt 56" level=debug msg="Running SSH command: <hidden>" level=debug msg="SSH command succeeded" level=debug msg="Waiting for availability of resource type 'secret'" level=debug msg="retry loop: attempt 0" level=debug msg="Running SSH command: timeout 5s oc get secret --context admin --cluster crc --kubeconfig /opt/kubeconfig" level=debug msg="SSH command results: err: <nil>, output: NAME TYPE DATA AGE\nbuilder-dockercfg-5gn6x kubernetes.io/dockercfg 1 31d\ndefault-dockercfg-5mnnm kubernetes.io/dockercfg 1 31d\ndeployer-dockercfg-psgvx kubernetes.io/dockercfg 1 31d\n" level=debug msg="NAME TYPE DATA AGE\nbuilder-dockercfg-5gn6x kubernetes.io/dockercfg 1 31d\ndefault-dockercfg-5mnnm kubernetes.io/dockercfg 1 31d\ndeployer-dockercfg-psgvx kubernetes.io/dockercfg 1 31d\n" level=debug msg="Running SSH command: <hidden>" level=debug msg="SSH command succeeded" level=info msg="Changing the password for the kubeadmin user" level=debug msg="Running SSH command: <hidden>" level=debug msg="SSH command succeeded" level=debug msg="Waiting for availability of resource type 'clusterversion'" level=debug msg="retry loop: attempt 0" level=debug msg="Running SSH command: timeout 5s oc get clusterversion --context admin --cluster crc --kubeconfig /opt/kubeconfig" level=debug msg="SSH command results: err: <nil>, output: NAME VERSION AVAILABLE PROGRESSING SINCE STATUS\nversion 4.16.7 True False 32d Cluster version is 4.16.7\n" level=debug msg="NAME VERSION AVAILABLE PROGRESSING SINCE STATUS\nversion 4.16.7 True False 32d Cluster version is 4.16.7\n" level=debug msg="Running SSH command: timeout 30s oc get clusterversion version -o jsonpath=\"{['spec']['clusterID']}\" --context admin --cluster crc --kubeconfig /opt/kubeconfig" level=debug msg="SSH command results: err: <nil>, output: " level=info msg="Updating cluster ID..." level=debug msg="Running SSH command: timeout 30s oc patch clusterversion version -p '{\"spec\":{\"clusterID\":\"21510edc-1943-4367-9b4a-cba48d657034\"}}' --type merge --context admin --cluster crc --kubeconfig /opt/kubeconfig" level=debug msg="SSH command results: err: <nil>, output: clusterversion.config.openshift.io/version patched\n" level=debug msg="Running SSH command: ls /opt/crc/routes-controller.yaml" level=debug msg="SSH command results: err: <nil>, output: /opt/crc/routes-controller.yaml\n" level=debug msg="Running SSH command: timeout 30s oc apply -f /opt/crc/routes-controller.yaml --context admin --cluster crc --kubeconfig /opt/kubeconfig" level=debug msg="SSH command results: err: <nil>, output: deployment.apps/routes-controller created\n" level=debug msg="Waiting for availability of resource type 'configmaps'" level=debug msg="retry loop: attempt 0" level=debug msg="Running SSH command: timeout 5s oc get configmaps --context admin --cluster crc --kubeconfig /opt/kubeconfig" level=debug msg="SSH command results: err: Process exited with status 124, output: " level=debug level=debug msg="error: Temporary error: ssh command error:\ncommand : timeout 5s oc get configmaps --context admin --cluster crc --kubeconfig /opt/kubeconfig\nerr : Process exited with status 124\n - sleeping 1s" level=debug msg="retry loop: attempt 1" level=debug msg="Running SSH command: timeout 5s oc get configmaps --context admin --cluster crc --kubeconfig /opt/kubeconfig" level=debug msg="SSH command results: err: Process exited with status 1, output: " level=debug msg="The connection to the server api.crc.testing:6443 was refused - did you specify the right host or port?\n" level=debug msg="error: Temporary error: ssh command error:\ncommand : timeout 5s oc get configmaps --context admin --cluster crc --kubeconfig /opt/kubeconfig\nerr : Process exited with status 1\n - sleeping 1s" level=debug msg="retry loop: attempt 2" level=debug msg="Running SSH command: timeout 5s oc get configmaps --context admin --cluster crc --kubeconfig /opt/kubeconfig" level=debug msg="SSH command results: err: Process exited with status 1, output: " level=debug msg="The connection to the server api.crc.testing:6443 was refused - did you specify the right host or port?\n" level=debug msg="error: Temporary error: ssh command error:\ncommand : timeout 5s oc get configmaps --context admin --cluster crc --kubeconfig /opt/kubeconfig\nerr : Process exited with status 1\n - sleeping 1s" level=debug msg="retry loop: attempt 3" level=debug msg="Running SSH command: timeout 5s oc get configmaps --context admin --cluster crc --kubeconfig /opt/kubeconfig" level=debug msg="SSH command results: err: Process exited with status 1, output: " level=debug msg="The connection to the server api.crc.testing:6443 was refused - did you specify the right host or port?\n" level=debug msg="error: Temporary error: ssh command error:\ncommand : timeout 5s oc get configmaps --context admin --cluster crc --kubeconfig /opt/kubeconfig\nerr : Process exited with status 1\n - sleeping 1s" level=debug msg="retry loop: attempt 4" level=debug msg="Running SSH command: timeout 5s oc get configmaps --context admin --cluster crc --kubeconfig /opt/kubeconfig" level=debug msg="SSH command results: err: Process exited with status 1, output: " level=debug msg="The connection to the server api.crc.testing:6443 was refused - did you specify the right host or port?\n" level=debug msg="error: Temporary error: ssh command error:\ncommand : timeout 5s oc get configmaps --context admin --cluster crc --kubeconfig /opt/kubeconfig\nerr : Process exited with status 1\n - sleeping 1s" level=debug msg="retry loop: attempt 5" level=debug msg="Running SSH command: timeout 5s oc get configmaps --context admin --cluster crc --kubeconfig /opt/kubeconfig" level=debug msg="SSH command results: err: Process exited with status 1, output: " level=debug msg="The connection to the server api.crc.testing:6443 was refused - did you specify the right host or port?\n" level=debug msg="error: Temporary error: ssh command error:\ncommand : timeout 5s oc get configmaps --context admin --cluster crc --kubeconfig /opt/kubeconfig\nerr : Process exited with status 1\n - sleeping 1s" level=debug msg="retry loop: attempt 6" level=debug msg="Running SSH command: timeout 5s oc get configmaps --context admin --cluster crc --kubeconfig /opt/kubeconfig" level=debug msg="SSH command results: err: Process exited with status 1, output: " level=debug msg="The connection to the server api.crc.testing:6443 was refused - did you specify the right host or port?\n" level=debug msg="error: Temporary error: ssh command error:\ncommand : timeout 5s oc get configmaps --context admin --cluster crc --kubeconfig /opt/kubeconfig\nerr : Process exited with status 1\n - sleeping 1s" level=debug msg="retry loop: attempt 7" level=debug msg="Running SSH command: timeout 5s oc get configmaps --context admin --cluster crc --kubeconfig /opt/kubeconfig" level=debug msg="SSH command results: err: Process exited with status 1, output: " level=debug msg="The connection to the server api.crc.testing:6443 was refused - did you specify the right host or port?\n" level=debug msg="error: Temporary error: ssh command error:\ncommand : timeout 5s oc get configmaps --context admin --cluster crc --kubeconfig /opt/kubeconfig\nerr : Process exited with status 1\n - sleeping 1s" level=debug msg="retry loop: attempt 8" level=debug msg="Running SSH command: timeout 5s oc get configmaps --context admin --cluster crc --kubeconfig /opt/kubeconfig" level=debug msg="SSH command results: err: Process exited with status 1, output: " level=debug msg="The connection to the server api.crc.testing:6443 was refused - did you specify the right host or port?\n" level=debug msg="error: Temporary error: ssh command error:\ncommand : timeout 5s oc get configmaps --context admin --cluster crc --kubeconfig /opt/kubeconfig\nerr : Process exited with status 1\n - sleeping 1s" level=debug msg="retry loop: attempt 9" level=debug msg="Running SSH command: timeout 5s oc get configmaps --context admin --cluster crc --kubeconfig /opt/kubeconfig" level=debug msg="SSH command results: err: Process exited with status 1, output: " level=debug msg="The connection to the server api.crc.testing:6443 was refused - did you specify the right host or port?\n" level=debug msg="error: Temporary error: ssh command error:\ncommand : timeout 5s oc get configmaps --context admin --cluster crc --kubeconfig /opt/kubeconfig\nerr : Process exited with status 1\n - sleeping 1s" level=debug msg="retry loop: attempt 10" level=debug msg="Running SSH command: timeout 5s oc get configmaps --context admin --cluster crc --kubeconfig /opt/kubeconfig" level=debug msg="SSH command results: err: Process exited with status 1, output: " level=debug msg="The connection to the server api.crc.testing:6443 was refused - did you specify the right host or port?\n" level=debug msg="error: Temporary error: ssh command error:\ncommand : timeout 5s oc get configmaps --context admin --cluster crc --kubeconfig /opt/kubeconfig\nerr : Process exited with status 1\n - sleeping 1s" level=debug msg="retry loop: attempt 11" level=debug msg="Running SSH command: timeout 5s oc get configmaps --context admin --cluster crc --kubeconfig /opt/kubeconfig" level=debug msg="SSH command results: err: Process exited with status 1, output: " level=debug msg="The connection to the server api.crc.testing:6443 was refused - did you specify the right host or port?\n" level=debug msg="error: Temporary error: ssh command error:\ncommand : timeout 5s oc get configmaps --context admin --cluster crc --kubeconfig /opt/kubeconfig\nerr : Process exited with status 1\n - sleeping 1s" level=debug msg="retry loop: attempt 12" level=debug msg="Running SSH command: timeout 5s oc get configmaps --context admin --cluster crc --kubeconfig /opt/kubeconfig" level=debug msg="SSH command results: err: Process exited with status 1, output: " level=debug msg="The connection to the server api.crc.testing:6443 was refused - did you specify the right host or port?\n" level=debug msg="error: Temporary error: ssh command error:\ncommand : timeout 5s oc get configmaps --context admin --cluster crc --kubeconfig /opt/kubeconfig\nerr : Process exited with status 1\n - sleeping 1s" level=debug msg="retry loop: attempt 13" level=debug msg="Running SSH command: timeout 5s oc get configmaps --context admin --cluster crc --kubeconfig /opt/kubeconfig" level=debug msg="SSH command results: err: Process exited with status 1, output: " level=debug msg="The connection to the server api.crc.testing:6443 was refused - did you specify the right host or port?\n" level=debug msg="error: Temporary error: ssh command error:\ncommand : timeout 5s oc get configmaps --context admin --cluster crc --kubeconfig /opt/kubeconfig\nerr : Process exited with status 1\n - sleeping 1s" level=debug msg="retry loop: attempt 14" level=debug msg="Running SSH command: timeout 5s oc get configmaps --context admin --cluster crc --kubeconfig /opt/kubeconfig" level=debug msg="SSH command results: err: Process exited with status 1, output: " level=debug msg="The connection to the server api.crc.testing:6443 was refused - did you specify the right host or port?\n" level=debug msg="error: Temporary error: ssh command error:\ncommand : timeout 5s oc get configmaps --context admin --cluster crc --kubeconfig /opt/kubeconfig\nerr : Process exited with status 1\n - sleeping 1s" level=debug msg="retry loop: attempt 15" level=debug msg="Running SSH command: timeout 5s oc get configmaps --context admin --cluster crc --kubeconfig /opt/kubeconfig" level=debug msg="SSH command results: err: Process exited with status 1, output: " level=debug msg="The connection to the server api.crc.testing:6443 was refused - did you specify the right host or port?\n" level=debug msg="error: Temporary error: ssh command error:\ncommand : timeout 5s oc get configmaps --context admin --cluster crc --kubeconfig /opt/kubeconfig\nerr : Process exited with status 1\n - sleeping 1s" level=debug msg="retry loop: attempt 16" level=debug msg="Running SSH command: timeout 5s oc get configmaps --context admin --cluster crc --kubeconfig /opt/kubeconfig" level=debug msg="SSH command results: err: Process exited with status 1, output: " level=debug msg="The connection to the server api.crc.testing:6443 was refused - did you specify the right host or port?\n" level=debug msg="error: Temporary error: ssh command error:\ncommand : timeout 5s oc get configmaps --context admin --cluster crc --kubeconfig /opt/kubeconfig\nerr : Process exited with status 1\n - sleeping 1s" level=debug msg="retry loop: attempt 17" level=debug msg="Running SSH command: timeout 5s oc get configmaps --context admin --cluster crc --kubeconfig /opt/kubeconfig" level=debug msg="SSH command results: err: Process exited with status 1, output: " level=debug msg="The connection to the server api.crc.testing:6443 was refused - did you specify the right host or port?\n" level=debug msg="error: Temporary error: ssh command error:\ncommand : timeout 5s oc get configmaps --context admin --cluster crc --kubeconfig /opt/kubeconfig\nerr : Process exited with status 1\n - sleeping 1s" level=debug msg="retry loop: attempt 18" level=debug msg="Running SSH command: timeout 5s oc get configmaps --context admin --cluster crc --kubeconfig /opt/kubeconfig" level=debug msg="SSH command results: err: Process exited with status 1, output: " level=debug msg="The connection to the server api.crc.testing:6443 was refused - did you specify the right host or port?\n" level=debug msg="error: Temporary error: ssh command error:\ncommand : timeout 5s oc get configmaps --context admin --cluster crc --kubeconfig /opt/kubeconfig\nerr : Process exited with status 1\n - sleeping 1s" level=debug msg="retry loop: attempt 19" level=debug msg="Running SSH command: timeout 5s oc get configmaps --context admin --cluster crc --kubeconfig /opt/kubeconfig" level=debug msg="SSH command results: err: Process exited with status 1, output: " level=debug msg="The connection to the server api.crc.testing:6443 was refused - did you specify the right host or port?\n" level=debug msg="error: Temporary error: ssh command error:\ncommand : timeout 5s oc get configmaps --context admin --cluster crc --kubeconfig /opt/kubeconfig\nerr : Process exited with status 1\n - sleeping 1s" level=debug msg="retry loop: attempt 20" level=debug msg="Running SSH command: timeout 5s oc get configmaps --context admin --cluster crc --kubeconfig /opt/kubeconfig" level=debug msg="SSH command results: err: Process exited with status 1, output: " level=debug msg="The connection to the server api.crc.testing:6443 was refused - did you specify the right host or port?\n" level=debug msg="error: Temporary error: ssh command error:\ncommand : timeout 5s oc get configmaps --context admin --cluster crc --kubeconfig /opt/kubeconfig\nerr : Process exited with status 1\n - sleeping 1s" level=debug msg="retry loop: attempt 21" level=debug msg="Running SSH command: timeout 5s oc get configmaps --context admin --cluster crc --kubeconfig /opt/kubeconfig" level=debug msg="SSH command results: err: Process exited with status 1, output: " level=debug msg="The connection to the server api.crc.testing:6443 was refused - did you specify the right host or port?\n" level=debug msg="error: Temporary error: ssh command error:\ncommand : timeout 5s oc get configmaps --context admin --cluster crc --kubeconfig /opt/kubeconfig\nerr : Process exited with status 1\n - sleeping 1s" level=debug msg="retry loop: attempt 22" level=debug msg="Running SSH command: timeout 5s oc get configmaps --context admin --cluster crc --kubeconfig /opt/kubeconfig" level=debug msg="SSH command results: err: Process exited with status 1, output: " level=debug msg="The connection to the server api.crc.testing:6443 was refused - did you specify the right host or port?\n" level=debug msg="error: Temporary error: ssh command error:\ncommand : timeout 5s oc get configmaps --context admin --cluster crc --kubeconfig /opt/kubeconfig\nerr : Process exited with status 1\n - sleeping 1s" level=debug msg="retry loop: attempt 23" level=debug msg="Running SSH command: timeout 5s oc get configmaps --context admin --cluster crc --kubeconfig /opt/kubeconfig" level=debug msg="SSH command results: err: Process exited with status 1, output: " level=debug msg="The connection to the server api.crc.testing:6443 was refused - did you specify the right host or port?\n" level=debug msg="error: Temporary error: ssh command error:\ncommand : timeout 5s oc get configmaps --context admin --cluster crc --kubeconfig /opt/kubeconfig\nerr : Process exited with status 1\n - sleeping 1s" level=debug msg="retry loop: attempt 24" level=debug msg="Running SSH command: timeout 5s oc get configmaps --context admin --cluster crc --kubeconfig /opt/kubeconfig" level=debug msg="SSH command results: err: Process exited with status 1, output: " level=debug msg="The connection to the server api.crc.testing:6443 was refused - did you specify the right host or port?\n" level=debug msg="error: Temporary error: ssh command error:\ncommand : timeout 5s oc get configmaps --context admin --cluster crc --kubeconfig /opt/kubeconfig\nerr : Process exited with status 1\n - sleeping 1s" level=debug msg="retry loop: attempt 25" level=debug msg="Running SSH command: timeout 5s oc get configmaps --context admin --cluster crc --kubeconfig /opt/kubeconfig" level=debug msg="SSH command results: err: Process exited with status 1, output: " level=debug msg="The connection to the server api.crc.testing:6443 was refused - did you specify the right host or port?\n" level=debug msg="error: Temporary error: ssh command error:\ncommand : timeout 5s oc get configmaps --context admin --cluster crc --kubeconfig /opt/kubeconfig\nerr : Process exited with status 1\n - sleeping 1s" level=debug msg="retry loop: attempt 26" level=debug msg="Running SSH command: timeout 5s oc get configmaps --context admin --cluster crc --kubeconfig /opt/kubeconfig" level=debug msg="SSH command results: err: Process exited with status 1, output: " level=debug msg="The connection to the server api.crc.testing:6443 was refused - did you specify the right host or port?\n" level=debug msg="error: Temporary error: ssh command error:\ncommand : timeout 5s oc get configmaps --context admin --cluster crc --kubeconfig /opt/kubeconfig\nerr : Process exited with status 1\n - sleeping 1s" level=debug msg="retry loop: attempt 27" level=debug msg="Running SSH command: timeout 5s oc get configmaps --context admin --cluster crc --kubeconfig /opt/kubeconfig" level=debug msg="SSH command results: err: Process exited with status 1, output: " level=debug msg="The connection to the server api.crc.testing:6443 was refused - did you specify the right host or port?\n" level=debug msg="error: Temporary error: ssh command error:\ncommand : timeout 5s oc get configmaps --context admin --cluster crc --kubeconfig /opt/kubeconfig\nerr : Process exited with status 1\n - sleeping 1s" level=debug msg="retry loop: attempt 28" level=debug msg="Running SSH command: timeout 5s oc get configmaps --context admin --cluster crc --kubeconfig /opt/kubeconfig" level=debug msg="SSH command results: err: Process exited with status 1, output: " level=debug msg="The connection to the server api.crc.testing:6443 was refused - did you specify the right host or port?\n" level=debug msg="error: Temporary error: ssh command error:\ncommand : timeout 5s oc get configmaps --context admin --cluster crc --kubeconfig /opt/kubeconfig\nerr : Process exited with status 1\n - sleeping 1s" level=debug msg="retry loop: attempt 29" level=debug msg="Running SSH command: timeout 5s oc get configmaps --context admin --cluster crc --kubeconfig /opt/kubeconfig" level=debug msg="SSH command results: err: Process exited with status 1, output: " level=debug msg="The connection to the server api.crc.testing:6443 was refused - did you specify the right host or port?\n" level=debug msg="error: Temporary error: ssh command error:\ncommand : timeout 5s oc get configmaps --context admin --cluster crc --kubeconfig /opt/kubeconfig\nerr : Process exited with status 1\n - sleeping 1s" level=debug msg="retry loop: attempt 30" level=debug msg="Running SSH command: timeout 5s oc get configmaps --context admin --cluster crc --kubeconfig /opt/kubeconfig" level=debug msg="SSH command results: err: Process exited with status 1, output: " level=debug msg="The connection to the server api.crc.testing:6443 was refused - did y
Integration.[It] Behind proxy wait for cluster in Running state [openshift-preset, goproxy]: Integration#L1
Unexpected error: <*errors.errorString | 0xc00062e340>: not found: running. Timeout { s: "not found: running. Timeout", } occurred
Overall cluster health: Overall cluster health#L1
Step executing "crc stop" succeeds: command 'crc stop', expected to succeed, exited with exit code: 1 Command stdout: Command stderr: level=debug msg="CRC version: 2.41.0+c17506\n" level=debug msg="OpenShift version: 4.16.7\n" level=debug msg="MicroShift version: 4.16.7\n" level=debug msg="Running 'crc stop'" level=debug msg="Checking file: C:\\Users\\rhqp\\.crc\\machines\\crc\\.crc-exist" level=debug msg="Checking file: C:\\Users\\rhqp\\.crc\\machines\\crc\\.crc-exist" level=debug msg="Machine: libhvee -> state" level=debug msg="Machine: libhvee -> get machine" level=debug msg="Machine: libhvee -> state: get" level=debug msg="Machine: libhvee -> state: running" level=debug msg="Checking file: C:\\Users\\rhqp\\.crc\\machines\\crc\\.crc-exist" level=info msg="Stopping kubelet and all containers..." level=debug msg="Using root access: Executing systemctl stop kubelet" level=debug msg="Running SSH command: sudo systemctl stop kubelet" level=debug msg="Using ssh private keys: [C:\\Users\\rhqp\\.crc\\machines\\crc\\id_ed25519 C:\\Users\\rhqp\\.crc\\cache\\crc_hyperv_4.16.7_amd64\\id_ecdsa_crc]" level=debug msg="SSH command results: err: <nil>, output: " level=debug msg="Using root access: stopping all containers" level=debug msg="Running SSH command: sudo -- sh -c 'crictl stop $(crictl ps -q)'" level=debug msg="SSH command results: err: Process exited with status 1, output: 0f89c37f2f1c4c8dbe4a10517a4298a7e3a8b21898eded7aa267a89162a18000\n9955f6ebe5cc73c29186316dc8028b37d383af82c449c25b748f4becba131241\n4d603ce4d36dd26041c1e8625537c61a492e102aee731e5e9ef22ebcf409eb1a\n2dfd09105217d076e88ab718d5a95749cbab3da15af25d57d40236933215ee28\n99298c008b9dacb168f5a57297c9dbfa28dcae376e5a72cac724f5313920b9f2\ndc44de21743abcbd44885dfbaa8b87466d630c1cc57bb5127fdc688de91cd40b\n513d5303a1b3fdbaa97135fa80f14737d7b7ff22393bf4d1e891e7aec939ef5c\n2724d03cac3ff92e0c73bed2c0a9440889455efea492f5fde830ca86e9a97e1f\nfe4b86a3c4c0d1d313e879e6892ea3532589847746ee03f55748a006485d925c\n6d0b189bb4ae21e466b0ebd49a6bf8bae61de507fe82eec42f3e1e1be41df4e4\n24453099e7ce9038b38ad9e7c1035d19f0907320801a69018807a24d679aa560\nec40a8330bf2bf1b52b165112743cb0d9842fe6cba263a70f86a94dc679e57b8\n38b900b99a1f7f742e2c2e653048095d4df5971e71269299bd003a32aaacf67e\nc40ae4c6258ec0c26f72b6b1de700166d670eaabdb4aed84bc8741d9a2205b64\nc0978c9db52a1d04ccae6a18296de5f56525e5e91c5beb1356f35b293c78f3ab\n1c43826126540228701e3cd805aaa2f18dbcb7224980c25c455974dfb4d4209d\nb0100a999782416503ce48dcc4df8d8d6e2df716de487ad1a658d1d0dd6f39de\ncf0dee8dbb94f01e47ab40d197af96c6b3192d6037555addf68eaab29cb126f7\ne9b14e86bc18849a6cee971ce01ad6c97fa1e51cfd818310ec86abdb14c8b38b\na65d33b1203cd5bfc327a8f69b924e22a36c7b94f9d0a18ff08184dd9b450a2d\necf75820735d33cf638c68fd221c90f2434e02b719f7aba4438cb9e91d28b644\n38b22de06b8540d1174c24d7fd75c95f02a7dda37f88561991e0e2c61c13e7e0\n" level=error msg="Failed to stop all containers: ssh command error:\ncommand : sudo -- sh -c 'crictl stop $(crictl ps -q)'\nerr : Process exited with status 1\n - E0920 12:33:39.773647 37129 remote_runtime.go:366] \"StopContainer from runtime service failed\" err=\"rpc error: code = DeadlineExceeded desc = context deadline exceeded\" containerID=\"eb2a68c0e46d142956dd206232bfd86f2b65023f1631c78de23d62ccbfc5c770\"\ntime=\"2024-09-20T12:33:39Z\" level=fatal msg=\"stopping the container \\\"eb2a68c0e46d142956dd206232bfd86f2b65023f1631c78de23d62ccbfc5c770\\\": rpc error: code = DeadlineExceeded desc = context deadline exceeded\"\n" level=warning msg="Failed to stop all OpenShift containers.\nShutting down VM..." level=debug msg="ssh command error:\ncommand : sudo -- sh -c 'crictl stop $(crictl ps -q)'\nerr : Process exited with status 1\n" level=info msg="Stopping the instance, this may take a few minutes..." level=debug msg="Stopping \"crc\"..." level=debug msg="Machine: libhvee -> state" level=debug msg="Machine: libhvee -> get machine" level=debug msg="Machine: libhvee -> state: get" level=debug msg="Machine: libhvee -> state: running" level=debug msg="Machine: libhvee -> get machine" level=debug msg="Machine: libhvee -> stop" level=debug msg="retry loop: attempt 0" level=debug msg="Machine: libhvee -> state" level=debug msg="Machine: libhvee -> get machine" level=debug msg="Machine: libhvee -> state: get" level=debug msg="Machine: libhvee -> state: running" level=debug msg="error: Temporary error: expected machine state Stopped, got Running - sleeping 3s" level=debug msg="retry loop: attempt 1" level=debug msg="Machine: libhvee -> state" level=debug msg="Machine: libhvee -> get machine" level=debug msg="Machine: libhvee -> state: get" level=debug msg="Machine: libhvee -> state: running" level=debug msg="error: Temporary error: expected machine state Stopped, got Running - sleeping 3s" level=debug msg="retry loop: attempt 2" level=debug msg="Machine: libhvee -> state" level=debug msg="Machine: libhvee -> get machine" level=debug msg="Machine: libhvee -> state: get" level=debug msg="Machine: libhvee -> state: running" level=debug msg="error: Temporary error: expected machine state Stopped, got Running - sleeping 3s" level=debug msg="retry loop: attempt 3" level=debug msg="Machine: libhvee -> state" level=debug msg="Machine: libhvee -> get machine" level=debug msg="Machine: libhvee -> state: get" level=debug msg="Machine: libhvee -> state: unknown" level=debug msg="non-retriable error: unknown state" level=debug msg="Machine: libhvee -> state" level=debug msg="Machine: libhvee -> get machine" level=debug msg="Machine: libhvee -> state: get" level=debug msg="Machine: libhvee -> state: unknown" level=debug msg="Cannot get VM status after stopping it: unknown state" Cannot stop machine: Temporary error: expected machine state Stopped, got Running (x3) unknown state
Install new operator: Install new operator#L1
Step with up to "4" retries with wait period of "30s" command "oc get pods -n openshift-marketplace" output matches ".*community-operators(.*)1/1(.*)Running.*": output did not match. Expected: '.*community-operators(.*)1/1(.*)Running.*', Actual: 'NAME READY STATUS RESTARTS AGE certified-operators-n9nz9 1/1 Running 0 2m4s community-operators-ltpww 0/1 Running 0 2m4s marketplace-operator-6c49cfc549-h2x8w 1/1 Running 0 2m9s redhat-marketplace-xbcpw 1/1 Running 0 2m7s redhat-operators-jf7l4 0/1 Running 0 2m6s redhat-operators-rznj2 0/1 Init:1/2 0 25s'
Overall cluster health: Overall cluster health#L1
Step ensuring CRC cluster is running: command '$env:CRC_DISABLE_UPDATE_CHECK=true; crc start -n 10.75.5.25 -p 'C:\Users\rhqp\crc-qe\pull-secret' ', expected to succeed, exited with exit code: 1 Command stdout: Command stderr: true : The term 'true' is not recognized as the name of a cmdlet, function, script file, or operable program. Check the spelling of the name, or if a path was included, verify that the path is correct and try again. At line:1 char:31 + $env:CRC_DISABLE_UPDATE_CHECK=true; crc start -n 10.75.5.25 -p 'C:\Us ... + ~~~~ + CategoryInfo : ObjectNotFound: (true:String) [], CommandNotFoundException + FullyQualifiedErrorId : CommandNotFoundException level=debug msg="CRC version: 2.41.0+db6f54\n" level=debug msg="OpenShift version: 4.16.7\n" level=debug msg="MicroShift version: 4.16.7\n" level=debug msg="Running 'crc start'" level=debug msg="Total memory of system is 34358562816 bytes" level=debug msg="No new version available. The latest version is 2.41.0" level=debug msg="Checking file: C:\\Users\\rhqp\\.crc\\machines\\crc\\.crc-exist" level=info msg="Using bundle path C:\\Users\\rhqp\\.crc\\cache\\crc_hyperv_4.16.7_amd64.crcbundle" level=info msg="Checking minimum RAM requirements" level=debug msg="Total memory of system is 34358562816 bytes" level=info msg="Check if Podman binary exists in: C:\\Users\\rhqp\\.crc\\bin\\oc" level=info msg="Checking if running in a shell with administrator rights" level=debug msg="Running '$currentPrincipal = New-Object Security.Principal.WindowsPrincipal([Security.Principal.WindowsIdentity]::GetCurrent());$currentPrincipal.IsInRole([Security.Principal.WindowsBuiltInRole]::Administrator)'" level=info msg="Checking Windows release" level=debug msg="Running '(Get-ItemProperty -Path \"HKLM:\\SOFTWARE\\Microsoft\\Windows NT\\CurrentVersion\" -Name ReleaseId).ReleaseId'" level=info msg="Checking Windows edition" level=debug msg="Running '(Get-ItemProperty -Path \"HKLM:\\SOFTWARE\\Microsoft\\Windows NT\\CurrentVersion\").EditionID'" level=debug msg="Running on Windows Enterprise edition" level=info msg="Checking if Hyper-V is installed and operational" level=debug msg="Running '@(Get-Wmiobject Win32_ComputerSystem).HypervisorPresent'" level=debug msg="Running '@(Get-Service vmms).Status'" level=info msg="Checking if Hyper-V service is enabled" level=debug msg="Running '@(Get-Service vmms).Status'" level=info msg="Checking if crc-users group exists" level=debug msg="Running 'Get-LocalGroup -Name crc-users'" level=info msg="Checking if current user is in crc-users and Hyper-V admins group" level=debug msg="Running '(Get-LocalGroupMember -Group 'crc-users').Name'" level=debug msg="Checking current user is in the 'crc-user' group" level=debug msg="group members: maptc1c61a0c\\rhqp" level=debug msg="Running '(Get-LocalGroupMember -SID 'S-1-5-32-578').Name'" level=debug msg="Checking current user is in the 'Hyper-v Administrators' group" level=debug msg="group members: maptc1c61a0c\\rhqp" level=info msg="Checking if vsock is correctly configured" level=debug msg="Running 'Get-Item -Path \"HKLM:\\SOFTWARE\\Microsoft\\Windows NT\\CurrentVersion\\Virtualization\\GuestCommunicationServices\\00000400-FACB-11E6-BD58-64006A7986D3\"'" level=info msg="Checking if the win32 background launcher is installed" level=debug msg="Running '(Get-Item 'C:\\Program Files\\Red Hat OpenShift Local\\crc-background-launcher.exe').VersionInfo.FileVersion'" level=debug msg="Found crc-background-launcher.exe version 0.0.0.1" level=info msg="Checking if the daemon task is installed" level=debug msg="Running 'Get-ScheduledTask -TaskName crcDaemon'" level=debug msg="Running '(Get-ScheduledTask -TaskName \"crcDaemon\").Version'" level=info msg="Checking if the daemon task is running" level=debug msg="Running '(Get-ScheduledTask -TaskName \"crcDaemon\").State'" level=info msg="Checking admin helper service is running" level=debug msg="Running '(Get-Service crcAdminHelper).Status'" level=info msg="Checking SSH port availability" level=debug msg="Checking file: C:\\Users\\rhqp\\.crc\\machines\\crc\\.crc-exist" level=debug msg="Copying 'C:\\Users\\rhqp\\.crc\\cache\\crc_hyperv_4.16.7_amd64\\oc.exe' to 'C:\\Users\\rhqp\\.crc\\bin\\oc\\oc.exe'" level=debug msg="Copying 'C:\\Users\\rhqp\\.crc\\cache\\crc_hyperv_4.16.7_amd64\\podman.exe' to 'C:\\Users\\rhqp\\.crc\\bin\\podman\\podman.exe'" level=info msg="Loading bundle: crc_hyperv_4.16.7_amd64..." level=debug msg="Using secret from configuration" level=info msg="Creating CRC VM for OpenShift 4.16.7..." level=debug msg="Running pre-create checks..." level=debug msg="Running '@(Get-Module -ListAvailable hyper-v).Name | Get-Unique'" level=debug msg="Running '@([Security.Principal.WindowsPrincipal][Security.Principal.WindowsIdentity]::GetCurrent()).IsInRole(([System.Security.Principal.SecurityIdentifier]::new(\"S-1-5-32-578\")))'" level=debug msg="Creating machine..." level=debug msg="Creating VM..." level=debug msg="Running 'Hyper-V\\New-VM crc -Path 'C:\\Users\\rhqp\\.crc\\machines\\crc' -MemoryStartupBytes 10752MB'" level=debug msg="Running 'Hyper-V\\Remove-VMNetworkAdapter -VMName crc'" level=debug msg="Running 'Hyper-V\\Set-VMMemory -VMName crc -DynamicMemoryEnabled $false'" level=debug msg="Running 'Hyper-V\\Set-VMProcessor crc -Count 4'" level=debug msg="Running 'Hyper-V\\Set-VM -VMName crc -AutomaticStartAction Nothing -AutomaticStopAction ShutDown -CheckpointType Disabled'" level=debug msg="Running 'Hyper-V\\Add-VMHardDiskDrive -VMName crc -Path 'C:\\Users\\rhqp\\.crc\\machines\\crc\\crc.vhdx''" level=debug msg="Running '@(Get-VHD -Path 'C:\\Users\\rhqp\\.crc\\machines\\crc\\crc.vhdx').Size'" level=debug msg="Resizing disk from 33285996544 bytes to 42949672960 bytes" level=debug msg="Running 'Hyper-V\\Resize-VHD -Path 'C:\\Users\\rhqp\\.crc\\machines\\crc\\crc.vhdx' -SizeBytes 42949672960'" level=info msg="Generating new SSH key pair..." level=info msg="Generating new password for the kubeadmin user" level=debug msg="Created C:\\Users\\rhqp\\.crc\\machines\\crc\\.crc-exist" level=debug msg="Machine successfully created" level=debug msg="Checking file: C:\\Users\\rhqp\\.crc\\machines\\crc\\.crc-exist" level=debug msg="Running 'Hyper-V\\Get-VM crc | Select-Object -ExpandProperty State'" level=debug msg="Copying 'C:\\Users\\rhqp\\.crc\\cache\\crc_hyperv_4.16.7_amd64\\oc.exe' to 'C:\\Users\\rhqp\\.crc\\bin\\oc\\oc.exe'" level=debug msg="Copying 'C:\\Users\\rhqp\\.crc\\cache\\crc_hyperv_4.16.7_amd64\\podman.exe' to 'C:\\Users\\rhqp\\.crc\\bin\\podman\\podman.exe'" level=info msg="Starting CRC VM for openshift 4.16.7..." level=debug msg="Updating CRC VM configuration" level=debug msg="Running 'Hyper-V\\Start-VM crc'" level=debug msg="Waiting for machine to be running, this may take a few minutes..." level=debug msg="retry loop: attempt 0" level=debug msg="Running 'Hyper-V\\Get-VM crc | Select-Object -ExpandProperty State'" level=debug msg="Machine is up and running!" level=debug msg="Running 'Hyper-V\\Get-VM crc | Select-Object -ExpandProperty State'" level=info msg="CRC instance is running with IP 127.0.0.1" level=debug msg="Waiting until ssh is available" level=debug msg="retry loop: attempt 0" level=debug msg="Running SSH command: exit 0" level=debug msg="Using ssh private keys: [C:\\Users\\rhqp\\.crc\\machines\\crc\\id_ed25519 C:\\Users\\rhqp\\.crc\\cache\\crc_hyperv_4.16.7_amd64\\id_ecdsa_crc]" level=debug msg="SSH command results: err: ssh: handshake failed: read tcp 127.0.0.1:52613->127.0.0.1:2222: wsarecv: An existing connection was forcibly closed by the remote host., output: " level=debug msg="error: Temporary error: ssh command error:\ncommand : exit 0\nerr : ssh: handshake failed: read tcp 127.0.0.1:52613->127.0.0.1:2222: wsarecv: An existing connection was forcibly closed by the remote host.\n - sleeping 1s" level=debug msg="retry loop: attempt 1" level=debug msg="Running SSH command: exit 0" level=debug msg="Using ssh private keys: [C:\\Users\\rhqp\\.crc\\machines\\crc\\id_ed25519 C:\\Users\\rhqp\\.crc\\cache\\crc_hyperv_4.16.7_amd64\\id_ecdsa_crc]" level=debug msg="SSH command results: err: ssh: handshake failed: read tcp 127.0.0.1:52614->127.0.0.1:2222: wsarecv: An existing connection was forcibly closed by the remote host., output: " level=debug msg="error: Temporary error: ssh command error:\ncommand : exit 0\nerr : ssh: handshake failed: read tcp 127.0.0.1:52614->127.0.0.1:2222: wsarecv: An existing connection was forcibly closed by the remote host.\n - sleeping 1s" level=debug msg="retry loop: attempt 2" level=debug msg="Running SSH command: exit 0" level=debug msg="Using ssh private keys: [C:\\Users\\rhqp\\.crc\\machines\\crc\\id_ed25519 C:\\Users\\rhqp\\.crc\\cache\\crc_hyperv_4.16.7_amd64\\id_ecdsa_crc]" level=debug msg="SSH command results: err: ssh: handshake failed: read tcp 127.0.0.1:52620->127.0.0.1:2222: wsarecv: An existing connection was forcibly closed by the remote host., output: " level=debug msg="error: Temporary error: ssh command error:\ncommand : exit 0\nerr : ssh: handshake failed: read tcp 127.0.0.1:52620->127.0.0.1:2222: wsarecv: An existing connection was forcibly closed by the remote host.\n - sleeping 1s" level=debug msg="retry loop: attempt 3" level=debug msg="Running SSH command: exit 0" level=debug msg="Using ssh private keys: [C:\\Users\\rhqp\\.crc\\machines\\crc\\id_ed25519 C:\\Users\\rhqp\\.crc\\cache\\crc_hyperv_4.16.7_amd64\\id_ecdsa_crc]" level=debug msg="SSH command results: err: <nil>, output: " level=info msg="CRC VM is running" level=debug msg="Using root access: disable core user password" level=debug msg="Running SSH command: sudo passwd --lock core" level=debug msg="SSH command results: err: <nil>, output: Locking password for user core.\npasswd: Success\n" level=debug msg="Running SSH command: cat /home/core/.ssh/authorized_keys" level=debug msg="SSH command results: err: Process exited with status 1, output: " level=info msg="Updating authorized keys..." level=debug msg="Creating /home/core/.ssh/authorized_keys with permissions 0644 in the CRC VM" level=debug msg="Running SSH command: <hidden>" level=debug msg="SSH command succeeded" level=debug msg="Running SSH command: rm /home/core/.ssh/authorized_keys.d/ignition" level=debug msg="SSH command results: err: <nil>, output: " level=debug msg="Using root access: Get device id" level=debug msg="Running SSH command: sudo /usr/sbin/blkid -t TYPE=xfs -o device" level=debug msg="SSH command results: err: <nil>, output: /dev/sda4\n" level=debug msg="Using root access: Growing /dev/sda4 partition" level=debug msg="Running SSH command: sudo /usr/bin/growpart /dev/sda 4" level=debug msg="SSH command results: err: <nil>, output: CHANGED: partition=4 start=1050624 old: size=63961055 end=65011678 new: size=82835423 end=83886046\n" level=info msg="Resizing /dev/sda4 filesystem" level=debug msg="Using root access: Remounting /sysroot read/write" level=debug msg="Running SSH command: sudo mount -o remount,rw /sysroot" level=debug msg="SSH command results: err: <nil>, output: " level=debug msg="Using root access: Growing /sysroot filesystem" level=debug msg="Running SSH command: sudo xfs_growfs /sysroot" level=debug msg="SSH command results: err: <nil>, output: meta-data=/dev/sda4 isize=512 agcount=43, agsize=188480 blks\n = sectsz=512 attr=2, projid32bit=1\n = crc=1 finobt=1, sparse=1, rmapbt=0\n = reflink=1 bigtime=1 inobtcount=1 nrext64=0\ndata = bsize=4096 blocks=7995131, imaxpct=25\n = sunit=0 swidth=0 blks\nnaming =version 2 bsize=4096 ascii-ci=0, ftype=1\nlog =internal log bsize=4096 blocks=16384, version=2\n = sectsz=512 sunit=0 blks, lazy-count=1\nrealtime =none extsz=4096 blocks=0, rtextents=0\ndata blocks changed from 7995131 to 10354427\n" level=debug msg="Running SSH command: cat /etc/resolv.conf" level=debug msg="SSH command results: err: <nil>, output: nameserver 192.168.127.1\n" level=info msg="Adding 10.75.5.25 as nameserver to the instance..." level=debug msg="Running SSH command: NS=10.75.5.25; cat /etc/resolv.conf |grep -i \"^nameserver $NS\" || echo \"nameserver $NS\" | sudo tee -a /etc/resolv.conf" level=debug msg="SSH command results: err: <nil>, output: nameserver 10.75.5.25\n" level=debug msg="Using root access: make root Podman socket accessible" level=debug msg="Running SSH command: sudo chmod 777 /run/podman/ /run/podman/podman.sock" level=debug msg="SSH command results: err: <nil>, output: " level=debug msg="Running SSH command: systemctl status ovs-configuration.service" level=debug msg="SSH command results: err: Process exited with status 3, output: ○ ovs-configuration.service - Configures OVS with proper host networking configuration\n Loaded: loaded (/etc/systemd/system/ovs-configuration.service; enabled; preset: disabled)\n Active: inactive (dead)\n" level=debug msg="Using root access: Executing systemctl daemon-reload command" level=debug msg="Running SSH command: sudo systemctl daemon-reload" level=debug msg="SSH command results: err: <nil>, output: " level=debug msg="Using root access: Executing systemctl start ovs-configuration.service" level=debug msg="Running SSH command: sudo systemctl start ovs-configuration.service" level=debug msg="SSH command results: err: <nil>, output: " level=debug msg="Using root access: Update resolv.conf file" level=debug msg="Running SSH command: sudo nmcli con modify --temporary ovs-if-br-ex ipv4.dns 192.168.127.1 ipv4.dns-search crc.testing" level=debug msg="SSH command results: err: <nil>, output: " level=debug msg="Using root access: Executing systemctl daemon-reload command" level=debug msg="Running SSH command: sudo systemctl daemon-reload" level=debug msg="SSH command results: err: <nil>, output: " level=debug msg="Using root access: Executing systemctl restart NetworkManager.service" level=debug msg="Running SSH command: sudo systemctl restart NetworkManager.service" level=debug msg="SSH command results: err: <nil>, output: " level=debug msg="retry loop: attempt 0" level=debug msg="Running SSH command: host -R 3 foo.apps-crc.testing" level=debug msg="SSH command results: err: <nil>, output: foo.apps-crc.testing has address 192.168.127.2\n" level=info msg="Check internal and public DNS query..." level=debug msg="Running SSH command: curl --head quay.io" level=debug msg="SSH command results: err: <nil>, output: HTTP/1.1 301 Moved Permanently\r\nServer: awselb/2.0\r\nDate: Fri, 20 Sep 2024 13:40:37 GMT\r\nContent-Type: text/html\r\nContent-Length: 134\r\nConnection: keep-alive\r\nLocation: https://quay.io:443/\r\n\r\n" level=info msg="Check DNS query from host..." level=debug msg="api.crc.testing resolved to [127.0.0.1]" level=info msg="Verifying validity of the kubelet certificates..." level=debug msg="Running SSH command: date --date=\"$(sudo openssl x509 -in /var/lib/kubelet/pki/kubelet-client-current.pem -noout -enddate | cut -d= -f 2)\" --iso-8601=seconds" level=debug msg="SSH command results: err: <nil>, output: 2025-08-20T06:19:22+00:00\n" level=debug msg="Running SSH command: date --date=\"$(sudo openssl x509 -in /var/lib/kubelet/pki/kubelet-server-current.pem -noout -enddate | cut -d= -f 2)\" --iso-8601=seconds" level=debug msg="SSH command results: err: <nil>, output: 2025-08-20T06:20:43+00:00\n" level=debug msg="Running SSH command: date --date=\"$(sudo openssl x509 -in /etc/kubernetes/static-pod-resources/kube-apiserver-certs/secrets/aggregator-client/tls.crt -noout -enddate | cut -d= -f 2)\" --iso-8601=seconds" level=debug msg="SSH command results: err: <nil>, output: 2025-08-20T06:21:53+00:00\n" level=info msg="Starting kubelet service" level=debug msg="Using root access: Executing systemctl daemon-reload command" level=debug msg="Running SSH command: sudo systemctl daemon-reload" level=debug msg="SSH command results: err: <nil>, output: " level=debug msg="Using root access: Executing systemctl start kubelet" level=debug msg="Running SSH command: sudo systemctl start kubelet" level=debug msg="SSH command results: err: <nil>, output: " level=info msg="Waiting for kube-apiserver availability... [takes around 2min]" level=debug msg="retry loop: attempt 0" level=debug msg="Running SSH command: timeout 5s oc get nodes --context admin --cluster crc --kubeconfig /opt/kubeconfig" level=debug msg="SSH command results: err: Process exited with status 1, output: " level=debug msg="E0920 13:40:41.818859 3816 memcache.go:265] couldn't get current server API group list: Get \"https://api.crc.testing:6443/api?timeout=32s\": dial tcp 192.168.127.2:6443: connect: connection refused\nE0920 13:40:41.819860 3816 memcache.go:265] couldn't get current server API group list: Get \"https://api.crc.testing:6443/api?timeout=32s\": dial tcp 192.168.127.2:6443: connect: connection refused\nE0920 13:40:41.821110 3816 memcache.go:265] couldn't get current server API group list: Get \"https://api.crc.testing:6443/api?timeout=32s\": dial tcp 192.168.127.2:6443: connect: connection refused\nE0920 13:40:41.822321 3816 memcache.go:265] couldn't get current server API group list: Get \"https://api.crc.testing:6443/api?timeout=32s\": dial tcp 192.168.127.2:6443: connect: connection refused\nE0920 13:40:41.823312 3816 memcache.go:265] couldn't get current server API group list: Get \"https://api.crc.testing:6443/api?timeout=32s\": dial tcp 192.168.127.2:6443: connect: connection refused\nThe connection to the server api.crc.testing:6443 was refused - did you specify the right host or port?\n" level=debug msg="error: Temporary error: ssh command error:\ncommand : timeout 5s oc get nodes --context admin --cluster crc --kubeconfig /opt/kubeconfig\nerr : Process exited with status 1\n - sleeping 1s" level=debug msg="retry loop: attempt 1" level=debug msg="Running SSH command: timeout 5s oc get nodes --context admin --cluster crc --kubeconfig /opt/kubeconfig" level=debug msg="SSH command results: err: Process exited with status 1, output: " level=debug msg="E0920 13:40:43.047217 4442 memcache.go:265] couldn't get current server API group list: Get \"https://api.crc.testing:6443/api?timeout=32s\": dial tcp 192.168.127.2:6443: connect: connection refused\nE0920 13:40:43.048179 4442 memcache.go:265] couldn't get current server API group list: Get \"https://api.crc.testing:6443/api?timeout=32s\": dial tcp 192.168.127.2:6443: connect: connection refused\nE0920 13:40:43.050774 4442 memcache.go:265] couldn't get current server API group list: Get \"https://api.crc.testing:6443/api?timeout=32s\": dial tcp 192.168.127.2:6443: connect: connection refused\nE0920 13:40:43.051789 4442 memcache.go:265] couldn't get current server API group list: Get \"https://api.crc.testing:6443/api?timeout=32s\": dial tcp 192.168.127.2:6443: connect: connection refused\nE0920 13:40:43.052735 4442 memcache.go:265] couldn't get current server API group list: Get \"https://api.crc.testing:6443/api?timeout=32s\": dial tcp 192.168.127.2:6443: connect: connection refused\nThe connection to the server api.crc.testing:6443 was refused - did you specify the right host or port?\n" level=debug msg="error: Temporary error: ssh command error:\ncommand : timeout 5s oc get nodes --context admin --cluster crc --kubeconfig /opt/kubeconfig\nerr : Process exited with status 1\n - sleeping 1s" level=debug msg="retry loop: attempt 2" level=debug msg="Running SSH command: timeout 5s oc get nodes --context admin --cluster crc --kubeconfig /opt/kubeconfig" level=debug msg="SSH command results: err: Process exited with status 124, output: " level=debug level=debug msg="error: Temporary error: ssh command error:\ncommand : timeout 5s oc get nodes --context admin --cluster crc --kubeconfig /opt/kubeconfig\nerr : Process exited with status 124\n - sleeping 1s" level=debug msg="retry loop: attempt 3" level=debug msg="Running SSH command: timeout 5s oc get nodes --context admin --cluster crc --kubeconfig /opt/kubeconfig" level=debug msg="SSH command results: err: Process exited with status 124, output: " level=debug level=debug msg="error: Temporary error: ssh command error:\ncommand : timeout 5s oc get nodes --context admin --cluster crc --kubeconfig /opt/kubeconfig\nerr : Process exited with status 124\n - sleeping 1s" level=debug msg="retry loop: attempt 4" level=debug msg="Running SSH command: timeout 5s oc get nodes --context admin --cluster crc --kubeconfig /opt/kubeconfig" level=debug msg="SSH command results: err: Process exited with status 124, output: " level=debug level=debug msg="error: Temporary error: ssh command error:\ncommand : timeout 5s oc get nodes --context admin --cluster crc --kubeconfig /opt/kubeconfig\nerr : Process exited with status 124\n - sleeping 1s" level=debug msg="retry loop: attempt 5" level=debug msg="Running SSH command: timeout 5s oc get nodes --context admin --cluster crc --kubeconfig /opt/kubeconfig" level=debug msg="SSH command results: err: <nil>, output: NAME STATUS ROLES AGE VERSION\ncrc NotReady control-plane,master,worker 32d v1.29.7+6abe8a1\n" level=debug msg="NAME STATUS ROLES AGE VERSION\ncrc NotReady control-plane,master,worker 32d v1.29.7+6abe8a1\n" level=debug msg="Waiting for availability of resource type 'configmap'" level=debug msg="retry loop: attempt 0" level=debug msg="Running SSH command: timeout 5s oc get configmap --context admin --cluster crc --kubeconfig /opt/kubeconfig" level=debug msg="SSH command results: err: <nil>, output: NAME DATA AGE\nkube-root-ca.crt 1 32d\nopenshift-service-ca.crt 1 32d\n" level=debug msg="NAME DATA AGE\nkube-root-ca.crt 1 32d\nopenshift-service-ca.crt 1 32d\n" level=debug msg="Running SSH command: timeout 30s oc delete -n openshift-machine-config-operator configmap machine-config-controller --context admin --cluster crc --kubeconfig /opt/kubeconfig" level=debug msg="SSH command results: err: Process exited with status 1, output: " level=debug msg="Waiting for availability of resource type 'lease'" level=debug msg="retry loop: attempt 0" level=debug msg="Running SSH command: timeout 5s oc get lease --context admin --cluster crc --kubeconfig /opt/kubeconfig" level=debug msg="SSH command results: err: <nil>, output: " level=debug level=debug msg="Running SSH command: timeout 30s oc delete -A lease --all --context admin --cluster crc --kubeconfig /opt/kubeconfig" level=debug msg="SSH command results: err: Process exited with status 124, output: lease.coordination.k8s.io \"crc\" deleted\nlease.coordination.k8s.io \"apiserver-yz2phfmetulqy4pemhbirhdnii\" deleted\nlease.coordination.k8s.io \"cluster-policy-controller-lock\" deleted\nlease.coordination.k8s.io \"kube-controller-manager\" deleted\nlease.coordination.k8s.io \"kube-scheduler\" deleted\nlease.coordination.k8s.io \"openshift-apiserver-operator-lock\" deleted\nlease.coordination.k8s.io \"cluster-authentication-operator-lock\" deleted\nlease.coordination.k8s.io \"cluster-machine-approver-leader\" deleted\nlease.coordination.k8s.io \"version\" deleted\nlease.coordination.k8s.io \"config-operator-lock\" deleted\nlease.coordination.k8s.io \"console-operator-lock\" deleted\nlease.coordination.k8s.io \"openshift-controller-manager-operator-lock\" deleted\nlease.coordination.k8s.io \"openshift-master-controllers\" deleted\nlease.coordination.k8s.io \"openshift-cluster-etcd-operator-lock\" deleted\nlease.coordination.k8s.io \"openshift-master-controllers\" deleted\nlease.coordination.k8s.io \"kube-apiserver-operator-lock\" deleted\nlease.coordination.k8s.io \"cert-regeneration-controller-lock\" deleted\nlease.coordination.k8s.io \"kube-controller-manager-operator-lock\" deleted\nlease.coordination.k8s.io \"cert-recovery-controller-lock\" deleted\nlease.coordination.k8s.io \"cluster-policy-controller-lock\" deleted\nlease.coordination.k8s.io \"openshift-cluster-kube-scheduler-operator-lock\" deleted\nlease.coordination.k8s.io \"cert-recovery-controller-lock\" deleted\nlease.coordination.k8s.io \"kube-scheduler\" deleted\nlease.coordination.k8s.io \"openshift-kube-storage-version-migrator-operator-lock\" deleted\nlease.coordination.k8s.io \"control-plane-machine-set-leader\" deleted\nlease.coordination.k8s.io \"machine-api-operator\" deleted\nlease.coordination.k8s.io \"machine-config\" deleted\nlease.coordination.k8s.io \"machine-config-controller\" deleted\nlease.coordination.k8s.io \"marketplace-operator-lock\" deleted\nlease.coordination.k8s.io \"ovnkube-identity\" deleted\nlease.coordination.k8s.io \"network-operator-lock\" deleted\nlease.coordination.k8s.io \"packageserver-controller-lock\" deleted\nlease.coordination.k8s.io \"ovn-kubernetes-master\" deleted\nlease.coordination.k8s.io \"openshift-route-controllers\" deleted\nlease.coordination.k8s.io \"service-ca-operator-lock\" deleted\nlease.coordination.k8s.io \"service-ca-controller-lock\" deleted\n" ssh command error: command : timeout 30s oc delete -A lease --all --context admin --cluster crc --kubeconfig /opt/kubeconfig err : Process exited with status 124
Install new operator: Install new operator#L1
Step executing "oc apply -f tekton-task.yaml" succeeds: command 'oc apply -f tekton-task.yaml', expected to succeed, exited with exit code: 1 Command stdout: taskrun.tekton.dev/echo-task-run created Command stderr: Error from server (InternalError): error when creating "tekton-task.yaml": Internal error occurred: resource quota evaluation timed out
Integration.[It] Behind proxy wait for cluster in Running state [openshift-preset, goproxy]: Integration#L1
Unexpected error: <*errors.errorString | 0xc0004c8180>: not found: running. Timeout { s: "not found: running. Timeout", } occurred
Integration.[It] Behind proxy wait for cluster in Running state [openshift-preset, goproxy]: Integration#L1
Unexpected error: <*errors.errorString | 0xc0003e82e0>: not found: running. Timeout { s: "not found: running. Timeout", } occurred
Integration.[It] Behind proxy wait for cluster in Running state [openshift-preset, goproxy]: Integration#L1
Unexpected error: <*errors.errorString | 0xc00047a190>: not found: running. Timeout { s: "not found: running. Timeout", } occurred
Overall cluster health: Overall cluster health#L1
Step starting CRC with default bundle succeeds: command '$env:CRC_DISABLE_UPDATE_CHECK=true; crc start -p 'C:\Users\rhqp\crc-qe\pull-secret' ', expected to succeed, exited with exit code: 1 Command stdout: Command stderr: true : The term 'true' is not recognized as the name of a cmdlet, function, script file, or operable program. Check the spelling of the name, or if a path was included, verify that the path is correct and try again. At line:1 char:31 + $env:CRC_DISABLE_UPDATE_CHECK=true; crc start -p 'C:\Users\rhqp\crc-q ... + ~~~~ + CategoryInfo : ObjectNotFound: (true:String) [], CommandNotFoundException + FullyQualifiedErrorId : CommandNotFoundException level=debug msg="CRC version: 2.41.0+d15067\n" level=debug msg="OpenShift version: 4.16.7\n" level=debug msg="MicroShift version: 4.16.7\n" level=debug msg="Running 'crc start'" level=debug msg="Total memory of system is 34358562816 bytes" level=debug msg="No new version available. The latest version is 2.41.0" level=debug msg="Checking file: C:\\Users\\rhqp\\.crc\\machines\\crc\\.crc-exist" level=debug msg="Running 'Hyper-V\\Get-VM crc | Select-Object -ExpandProperty State'" level=info msg="Using bundle path C:\\Users\\rhqp\\.crc\\cache\\crc_hyperv_4.16.7_amd64.crcbundle" level=info msg="Checking minimum RAM requirements" level=debug msg="Total memory of system is 34358562816 bytes" level=info msg="Check if Podman binary exists in: C:\\Users\\rhqp\\.crc\\bin\\oc" level=info msg="Checking if running in a shell with administrator rights" level=debug msg="Running '$currentPrincipal = New-Object Security.Principal.WindowsPrincipal([Security.Principal.WindowsIdentity]::GetCurrent());$currentPrincipal.IsInRole([Security.Principal.WindowsBuiltInRole]::Administrator)'" level=info msg="Checking Windows release" level=debug msg="Running '(Get-ItemProperty -Path \"HKLM:\\SOFTWARE\\Microsoft\\Windows NT\\CurrentVersion\" -Name ReleaseId).ReleaseId'" level=info msg="Checking Windows edition" level=debug msg="Running '(Get-ItemProperty -Path \"HKLM:\\SOFTWARE\\Microsoft\\Windows NT\\CurrentVersion\").EditionID'" level=debug msg="Running on Windows Enterprise edition" level=info msg="Checking if Hyper-V is installed and operational" level=debug msg="Running '@(Get-Wmiobject Win32_ComputerSystem).HypervisorPresent'" level=debug msg="Running '@(Get-Service vmms).Status'" level=info msg="Checking if Hyper-V service is enabled" level=debug msg="Running '@(Get-Service vmms).Status'" level=info msg="Checking if crc-users group exists" level=debug msg="Running 'Get-LocalGroup -Name crc-users'" level=info msg="Checking if current user is in crc-users and Hyper-V admins group" level=debug msg="Running '(Get-LocalGroupMember -Group 'crc-users').Name'" level=debug msg="Checking current user is in the 'crc-user' group" level=debug msg="group members: mapt0ec338fc\\rhqp" level=debug msg="Running '(Get-LocalGroupMember -SID 'S-1-5-32-578').Name'" level=debug msg="Checking current user is in the 'Hyper-v Administrators' group" level=debug msg="group members: mapt0ec338fc\\rhqp" level=info msg="Checking if vsock is correctly configured" level=debug msg="Running 'Get-Item -Path \"HKLM:\\SOFTWARE\\Microsoft\\Windows NT\\CurrentVersion\\Virtualization\\GuestCommunicationServices\\00000400-FACB-11E6-BD58-64006A7986D3\"'" level=info msg="Checking if the win32 background launcher is installed" level=debug msg="Running '(Get-Item 'C:\\Program Files\\Red Hat OpenShift Local\\crc-background-launcher.exe').VersionInfo.FileVersion'" level=debug msg="Found crc-background-launcher.exe version 0.0.0.1" level=info msg="Checking if the daemon task is installed" level=debug msg="Running 'Get-ScheduledTask -TaskName crcDaemon'" level=debug msg="Running '(Get-ScheduledTask -TaskName \"crcDaemon\").Version'" level=info msg="Checking if the daemon task is running" level=debug msg="Running '(Get-ScheduledTask -TaskName \"crcDaemon\").State'" level=info msg="Checking admin helper service is running" level=debug msg="Running '(Get-Service crcAdminHelper).Status'" level=info msg="Checking SSH port availability" level=debug msg="Checking file: C:\\Users\\rhqp\\.crc\\machines\\crc\\.crc-exist" level=debug msg="Copying 'C:\\Users\\rhqp\\.crc\\cache\\crc_hyperv_4.16.7_amd64\\oc.exe' to 'C:\\Users\\rhqp\\.crc\\bin\\oc\\oc.exe'" level=debug msg="Copying 'C:\\Users\\rhqp\\.crc\\cache\\crc_hyperv_4.16.7_amd64\\podman.exe' to 'C:\\Users\\rhqp\\.crc\\bin\\podman\\podman.exe'" level=info msg="Loading bundle: crc_hyperv_4.16.7_amd64..." level=debug msg="Checking file: C:\\Users\\rhqp\\.crc\\machines\\crc\\.crc-exist" level=debug msg="Running 'Hyper-V\\Get-VM crc | Select-Object -ExpandProperty State'" level=debug msg="Copying 'C:\\Users\\rhqp\\.crc\\cache\\crc_hyperv_4.16.7_amd64\\oc.exe' to 'C:\\Users\\rhqp\\.crc\\bin\\oc\\oc.exe'" level=debug msg="Copying 'C:\\Users\\rhqp\\.crc\\cache\\crc_hyperv_4.16.7_amd64\\podman.exe' to 'C:\\Users\\rhqp\\.crc\\bin\\podman\\podman.exe'" level=info msg="Starting CRC VM for openshift 4.16.7..." level=debug msg="Updating CRC VM configuration" level=debug msg="Running 'Hyper-V\\Start-VM crc'" level=debug msg="Waiting for machine to be running, this may take a few minutes..." level=debug msg="retry loop: attempt 0" level=debug msg="Running 'Hyper-V\\Get-VM crc | Select-Object -ExpandProperty State'" level=debug msg="Machine is up and running!" level=debug msg="Running 'Hyper-V\\Get-VM crc | Select-Object -ExpandProperty State'" level=info msg="CRC instance is running with IP 127.0.0.1" level=debug msg="Waiting until ssh is available" level=debug msg="retry loop: attempt 0" level=debug msg="Running SSH command: exit 0" level=debug msg="Using ssh private keys: [C:\\Users\\rhqp\\.crc\\machines\\crc\\id_ed25519 C:\\Users\\rhqp\\.crc\\cache\\crc_hyperv_4.16.7_amd64\\id_ecdsa_crc]" level=debug msg="SSH command results: err: ssh: handshake failed: read tcp 127.0.0.1:56743->127.0.0.1:2222: wsarecv: An existing connection was forcibly closed by the remote host., output: " level=debug msg="error: Temporary error: ssh command error:\ncommand : exit 0\nerr : ssh: handshake failed: read tcp 127.0.0.1:56743->127.0.0.1:2222: wsarecv: An existing connection was forcibly closed by the remote host.\n - sleeping 1s" level=debug msg="retry loop: attempt 1" level=debug msg="Running SSH command: exit 0" level=debug msg="Using ssh private keys: [C:\\Users\\rhqp\\.crc\\machines\\crc\\id_ed25519 C:\\Users\\rhqp\\.crc\\cache\\crc_hyperv_4.16.7_amd64\\id_ecdsa_crc]" level=debug msg="SSH command results: err: <nil>, output: " level=info msg="CRC VM is running" level=debug msg="Using root access: disable core user password" level=debug msg="Running SSH command: sudo passwd --lock core" level=debug msg="SSH command results: err: <nil>, output: Locking password for user core.\npasswd: Success\n" level=debug msg="Running SSH command: cat /home/core/.ssh/authorized_keys" level=debug msg="SSH command results: err: Process exited with status 1, output: " level=info msg="Updating authorized keys..." level=debug msg="Creating /home/core/.ssh/authorized_keys with permissions 0644 in the CRC VM" level=debug msg="Running SSH command: <hidden>" level=debug msg="SSH command succeeded" level=debug msg="Running SSH command: rm /home/core/.ssh/authorized_keys.d/ignition" level=debug msg="SSH command results: err: <nil>, output: " level=debug msg="Using root access: Get device id" level=debug msg="Running SSH command: sudo /usr/sbin/blkid -t TYPE=xfs -o device" level=debug msg="SSH command results: err: <nil>, output: /dev/sda4\n" level=debug msg="Using root access: Growing /dev/sda4 partition" level=debug msg="Running SSH command: sudo /usr/bin/growpart /dev/sda 4" level=debug msg="SSH command results: err: Process exited with status 1, output: NOCHANGE: partition 4 is size 82835423. it cannot be grown\n" level=debug msg="No free space after /dev/sda4, nothing to do" level=debug msg="Using root access: make root Podman socket accessible" level=debug msg="Running SSH command: sudo chmod 777 /run/podman/ /run/podman/podman.sock" level=debug msg="SSH command results: err: <nil>, output: " level=debug msg="Running SSH command: systemctl status ovs-configuration.service" level=debug msg="SSH command results: err: Process exited with status 3, output: ● ovs-configuration.service - Configures OVS with proper host networking configuration\n Loaded: loaded (/etc/systemd/system/ovs-configuration.service; enabled; preset: disabled)\n Active: activating (start) since Fri 2024-09-20 14:40:02 UTC; 598ms ago\n Main PID: 1509 (configure-ovs.s)\n Tasks: 2 (limit: 66259)\n Memory: 62.2M\n CPU: 378ms\n CGroup: /system.slice/ovs-configuration.service\n ├─1509 /bin/bash /usr/local/bin/configure-ovs.sh OVNKubernetes\n ├─1513 /bin/bash /usr/local/bin/configure-ovs.sh OVNKubernetes\n └─1861 /bin/bash /usr/local/bin/configure-ovs.sh OVNKubernetes\n\nSep 20 14:40:03 crc configure-ovs.sh[1653]: 192.168.126.0/24 dev eth10 proto kernel scope link src 192.168.126.11 metric 550\nSep 20 14:40:03 crc configure-ovs.sh[1653]: 192.168.127.0/24 dev tap0 proto kernel scope link src 192.168.127.2\nSep 20 14:40:03 crc configure-ovs.sh[1513]: + ip -6 route show\nSep 20 14:40:03 crc configure-ovs.sh[1656]: ::1 dev lo proto kernel metric 256 pref medium\nSep 20 14:40:03 crc configure-ovs.sh[1656]: fe80::/64 dev tap0 proto kernel metric 256 pref medium\nSep 20 14:40:03 crc configure-ovs.sh[1513]: + '[' OVNKubernetes == OVNKubernetes ']'\nSep 20 14:40:03 crc configure-ovs.sh[1513]: + ovnk_config_dir=/etc/ovnk\nSep 20 14:40:03 crc configure-ovs.sh[1513]: + ovnk_var_dir=/var/lib/ovnk\nSep 20 14:40:03 crc configure-ovs.sh[1513]: + extra_bridge_file=/etc/ovnk/extra_bridge\nSep 20 14:40:03 crc configure-ovs.sh[1513]: + iface_default_hint_file=/var/lib/ovnk/iface_default_hint\n" level=debug msg="Creating /etc/resolv.conf with permissions 0644 in the CRC VM" level=debug msg="Running SSH command: <hidden>" level=debug msg="SSH command succeeded" level=debug msg="retry loop: attempt 0" level=debug msg="Running SSH command: host -R 3 foo.apps-crc.testing" level=debug msg="SSH command results: err: <nil>, output: foo.apps-crc.testing has address 192.168.127.2\n" level=info msg="Check internal and public DNS query..." level=debug msg="Running SSH command: curl --head quay.io" level=debug msg="SSH command results: err: <nil>, output: HTTP/1.1 301 Moved Permanently\r\nServer: awselb/2.0\r\nDate: Fri, 20 Sep 2024 14:40:03 GMT\r\nContent-Type: text/html\r\nContent-Length: 134\r\nConnection: keep-alive\r\nLocation: https://quay.io:443/\r\n\r\n" level=info msg="Check DNS query from host..." level=debug msg="api.crc.testing resolved to [127.0.0.1]" level=info msg="Verifying validity of the kubelet certificates..." level=debug msg="Running SSH command: date --date=\"$(sudo openssl x509 -in /var/lib/kubelet/pki/kubelet-client-current.pem -noout -enddate | cut -d= -f 2)\" --iso-8601=seconds" level=debug msg="SSH command results: err: <nil>, output: 2025-08-20T06:19:22+00:00\n" level=debug msg="Running SSH command: date --date=\"$(sudo openssl x509 -in /var/lib/kubelet/pki/kubelet-server-current.pem -noout -enddate | cut -d= -f 2)\" --iso-8601=seconds" level=debug msg="SSH command results: err: <nil>, output: 2025-08-20T06:20:43+00:00\n" level=debug msg="Running SSH command: date --date=\"$(sudo openssl x509 -in /etc/kubernetes/static-pod-resources/kube-apiserver-certs/secrets/aggregator-client/tls.crt -noout -enddate | cut -d= -f 2)\" --iso-8601=seconds" level=debug msg="SSH command results: err: <nil>, output: 2025-08-20T06:21:53+00:00\n" level=info msg="Starting kubelet service" level=debug msg="Using root access: Executing systemctl daemon-reload command" level=debug msg="Running SSH command: sudo systemctl daemon-reload" level=debug msg="SSH command results: err: <nil>, output: " level=debug msg="Using root access: Executing systemctl start kubelet" level=debug msg="Running SSH command: sudo systemctl start kubelet" level=debug msg="SSH command results: err: <nil>, output: " level=info msg="Waiting for kube-apiserver availability... [takes around 2min]" level=debug msg="retry loop: attempt 0" level=debug msg="Running SSH command: timeout 5s oc get nodes --context admin --cluster crc --kubeconfig /opt/kubeconfig" level=debug msg="SSH command results: err: Process exited with status 1, output: " level=debug msg="The connection to the server api.crc.testing:6443 was refused - did you specify the right host or port?\n" level=debug msg="error: Temporary error: ssh command error:\ncommand : timeout 5s oc get nodes --context admin --cluster crc --kubeconfig /opt/kubeconfig\nerr : Process exited with status 1\n - sleeping 1s" level=debug msg="retry loop: attempt 1" level=debug msg="Running SSH command: timeout 5s oc get nodes --context admin --cluster crc --kubeconfig /opt/kubeconfig" level=debug msg="SSH command results: err: Process exited with status 1, output: " level=debug msg="The connection to the server api.crc.testing:6443 was refused - did you specify the right host or port?\n" level=debug msg="error: Temporary error: ssh command error:\ncommand : timeout 5s oc get nodes --context admin --cluster crc --kubeconfig /opt/kubeconfig\nerr : Process exited with status 1\n - sleeping 1s" level=debug msg="retry loop: attempt 2" level=debug msg="Running SSH command: timeout 5s oc get nodes --context admin --cluster crc --kubeconfig /opt/kubeconfig" level=debug msg="SSH command results: err: Process exited with status 124, output: " level=debug level=debug msg="error: Temporary error: ssh command error:\ncommand : timeout 5s oc get nodes --context admin --cluster crc --kubeconfig /opt/kubeconfig\nerr : Process exited with status 124\n - sleeping 1s" level=debug msg="retry loop: attempt 3" level=debug msg="Running SSH command: timeout 5s oc get nodes --context admin --cluster crc --kubeconfig /opt/kubeconfig" level=debug msg="SSH command results: err: Process exited with status 124, output: " level=debug level=debug msg="error: Temporary error: ssh command error:\ncommand : timeout 5s oc get nodes --context admin --cluster crc --kubeconfig /opt/kubeconfig\nerr : Process exited with status 124\n - sleeping 1s" level=debug msg="retry loop: attempt 4" level=debug msg="Running SSH command: timeout 5s oc get nodes --context admin --cluster crc --kubeconfig /opt/kubeconfig" level=debug msg="SSH command results: err: <nil>, output: NAME STATUS ROLES AGE VERSION\ncrc Ready control-plane,master,worker 32d v1.29.7+6abe8a1\n" level=debug msg="NAME STATUS ROLES AGE VERSION\ncrc Ready control-plane,master,worker 32d v1.29.7+6abe8a1\n" level=debug msg="Waiting for availability of resource type 'configmap'" level=debug msg="retry loop: attempt 0" level=debug msg="Running SSH command: timeout 5s oc get configmap --context admin --cluster crc --kubeconfig /opt/kubeconfig" level=debug msg="SSH command results: err: <nil>, output: NAME DATA AGE\nkube-root-ca.crt 1 32d\nopenshift-service-ca.crt 1 32d\n" level=debug msg="NAME DATA AGE\nkube-root-ca.crt 1 32d\nopenshift-service-ca.crt 1 32d\n" level=debug msg="Running SSH command: timeout 30s oc delete -n openshift-machine-config-operator configmap machine-config-controller --context admin --cluster crc --kubeconfig /opt/kubeconfig" level=debug msg="SSH command results: err: Process exited with status 1, output: " level=debug msg="Waiting for availability of resource type 'lease'" level=debug msg="retry loop: attempt 0" level=debug msg="Running SSH command: timeout 5s oc get lease --context admin --cluster crc --kubeconfig /opt/kubeconfig" level=debug msg="SSH command results: err: <nil>, output: " level=debug level=debug msg="Running SSH command: timeout 30s oc delete -A lease --all --context admin --cluster crc --kubeconfig /opt/kubeconfig" level=debug msg="SSH command results: err: <nil>, output: lease.coordination.k8s.io \"crc\" deleted\nlease.coordination.k8s.io \"apiserver-yz2phfmetulqy4pemhbirhdnii\" deleted\nlease.coordination.k8s.io \"kube-controller-manager\" deleted\nlease.coordination.k8s.io \"openshift-apiserver-operator-lock\" deleted\nlease.coordination.k8s.io \"cluster-authentication-operator-lock\" deleted\nlease.coordination.k8s.io \"cluster-machine-approver-leader\" deleted\nlease.coordination.k8s.io \"version\" deleted\nlease.coordination.k8s.io \"config-operator-lock\" deleted\nlease.coordination.k8s.io \"console-operator-lock\" deleted\nlease.coordination.k8s.io \"openshift-controller-manager-operator-lock\" deleted\nlease.coordination.k8s.io \"openshift-master-controllers\" deleted\nlease.coordination.k8s.io \"openshift-cluster-etcd-operator-lock\" deleted\nlease.coordination.k8s.io \"openshift-master-controllers\" deleted\nlease.coordination.k8s.io \"kube-apiserver-operator-lock\" deleted\nlease.coordination.k8s.io \"cert-regeneration-controller-lock\" deleted\nlease.coordination.k8s.io \"kube-controller-manager-operator-lock\" deleted\nlease.coordination.k8s.io \"cert-recovery-controller-lock\" deleted\nlease.coordination.k8s.io \"cluster-policy-controller-lock\" deleted\nlease.coordination.k8s.io \"openshift-cluster-kube-scheduler-operator-lock\" deleted\nlease.coordination.k8s.io \"cert-recovery-controller-lock\" deleted\nlease.coordination.k8s.io \"kube-scheduler\" deleted\nlease.coordination.k8s.io \"openshift-kube-storage-version-migrator-operator-lock\" deleted\nlease.coordination.k8s.io \"control-plane-machine-set-leader\" deleted\nlease.coordination.k8s.io \"machine-api-operator\" deleted\nlease.coordination.k8s.io \"machine-config\" deleted\nlease.coordination.k8s.io \"machine-config-controller\" deleted\nlease.coordination.k8s.io \"marketplace-operator-lock\" deleted\nlease.coordination.k8s.io \"ovnkube-identity\" deleted\nlease.coordination.k8s.io \"network-operator-lock\" deleted\nlease.coordination.k8s.io \"packageserver-controller-lock\" deleted\nlease.coordination.k8s.io \"ovn-kubernetes-master\" deleted\nlease.coordination.k8s.io \"openshift-route-controllers\" deleted\nlease.coordination.k8s.io \"service-ca-operator-lock\" deleted\nlease.coordination.k8s.io \"service-ca-controller-lock\" deleted\n" level=debug msg="Waiting for availability of resource type 'secret'" level=debug msg="retry loop: attempt 0" level=debug msg="Running SSH command: timeout 5s oc get secret --context admin --cluster crc --kubeconfig /opt/kubeconfig" level=debug msg="SSH command results: err: <nil>, output: NAME TYPE DATA AGE\nbuilder-dockercfg-5gn6x kubernetes.io/dockercfg 1 31d\ndefault-dockercfg-5mnnm kubernetes.io/dockercfg 1 31d\ndeployer-dockercfg-psgvx kubernetes.io/dockercfg 1 31d\n" level=debug msg="NAME TYPE DATA AGE\nbuilder-dockercfg-5gn6x kubernetes.io/dockercfg 1 31d\ndefault-dockercfg-5mnnm kubernetes.io/dockercfg 1 31d\ndeployer-dockercfg-psgvx kubernetes.io/dockercfg 1 31d\n" level=debug msg="Running SSH command: <hidden>" level=debug msg="SSH command succeeded" level=debug msg="Waiting for availability of resource type 'machineconfigs'" level=debug msg="retry loop: attempt 0" level=debug msg="Running SSH command: timeout 5s oc get machineconfigs --context admin --cluster crc --kubeconfig /opt/kubeconfig" level=debug msg="SSH command results: err: <nil>, output: NAME GENERATEDBYCONTROLLER IGNITIONVERSION AGE\n00-master 64434515dba546949bcec20be26f3215a4fc5b53 3.4.0 32d\n00-worker 64434515dba546949bcec20be26f3215a4fc5b53 3.4.0 32d\n01-master-container-runtime 64434515dba546949bcec20be26f3215a4fc5b53 3.4.0 32d\n01-master-kubelet 64434515dba546949bcec20be26f3215a4fc5b53 3.4.0 32d\n01-worker-container-runtime 64434515dba546949bcec20be26f3215a4fc5b53 3.4.0 32d\n01-worker-kubelet 64434515dba546949bcec20be26f3215a4fc5b53 3.4.0 32d\n97-master-generated-kubelet 64434515dba546949bcec20be26f3215a4fc5b53 3.4.0 32d\n97-worker-generated-kubelet 64434515dba546949bcec20be26f3215a4fc5b53 3.4.0 32d\n98-master-generated-kubelet 64434515dba546949bcec20be26f3215a4fc5b53 3.4.0 32d\n98-worker-generated-kubelet 64434515dba546949bcec20be26f3215a4fc5b53 3.4.0 32d\n99-master-generated-registries 64434515dba546949bcec20be26f3215a4fc5b53 3.4.0 32d\n99-master-ssh 3.2.0 32d\n99-node-sizing-for-crc 3.2.0 32d\n99-openshift-machineconfig-master-dummy-networks 3.2.0 32d\n99-worker-generated-registries 64434515dba546949bcec20be26f3215a4fc5b53 3.4.0 32d\n99-worker-ssh 3.2.0 32d\nrendered-master-0cf69d971f2ceb3659e70ca3f297c665 64434515dba546949bcec20be26f3215a4fc5b53 3.4.0 8m54s\nrendered-master-26801239634efb1cea7baf08bf726a3d 64434515dba546949bcec20be26f3215a4fc5b53 3.4.0 9m1s\nrendered-master-af3c83ca74c63b4b8a3a3381b9851b1f 64434515dba546949bcec20be26f3215a4fc5b53 3.4.0 31d\nrendered-worker-91948eef8073f13496e3addf4c9db852 64434515dba546949bcec20be26f3215a4fc5b53 3.4.0 8m55s\nrendered-worker-b45d4d2f8d21449c9543a709a1728281 64434515dba546949bcec20be26f3215a4fc5b53 3.4.0 31d\n" level=debug msg="NAME GENERATEDBYCONTROLLER IGNITIONVERSION AGE\n00-master 64434515dba546949bcec20be26f3215a4fc5b53 3.4.0 32d\n00-worker 64434515dba546949bcec20be26f3215a4fc5b53 3.4.0 32d\n01-master-container-runtime 64434515dba546949bcec20be26f3215a4fc5b53 3.4.0 32d\n01-master-kubelet 64434515dba546949bcec20be26f3215a4fc5b53 3.4.0 32d\n01-worker-container-runtime 64434515dba546949bcec20be26f3215a4fc5b53 3.4.0 32d\n01-worker-kubelet 64434515dba546949bcec20be26f3215a4fc5b53 3.4.0 32d\n97-master-generated-kubelet 64434515dba546949bcec20be26f3215a4fc5b53 3.4.0 32d\n97-worker-generated-kubelet 64434515dba546949bcec20be26f3215a4fc5b53 3.4.0 32d\n98-master-generated-kubelet 64434515dba546949bcec20be26f3215a4fc5b53 3.4.0 32d\n98-worker-generated-kubelet 64434515dba546949bcec20be26f3215a4fc5b53 3.4.0 32d\n99-master-generated-registries 64434515dba546949bcec20be26f3215a4fc5b53 3.4.0 32d\n99-master-ssh 3.2.0 32d\n99-node-sizing-for-crc 3.2.0 32d\n99-openshift-machineconfig-master-dummy-networks 3.2.0 32d\n99-worker-generated-registries 64434515dba546949bcec20be26f3215a4fc5b53 3.4.0 32d\n99-worker-ssh 3.2.0 32d\nrendered-master-0cf69d971f2ceb3659e70ca3f297c665 64434515dba546949bcec20be26f3215a4fc5b53 3.4.0 8m54s\nrendered-master-26801239634efb1cea7baf08bf726a3d 64434515dba546949bcec20be26f3215a4fc5b53 3.4.0 9m1s\nrendered-master-af3c83ca74c63b4b8a3a3381b9851b1f 64434515dba546949bcec20be26f3215a4fc5b53 3.4.0 31d\nrendered-worker-91948eef8073f13496e3addf4c9db852 64434515dba546949bcec20be26f3215a4fc5b53 3.4.0 8m55s\nrendered-worker-b45d4d2f8d21449c9543a709a1728281 64434515dba546949bcec20be26f3215a4fc5b53 3.4.0 31d\n" level=debug msg="Running SSH command: timeout 30s oc get machineconfigs 99-master-ssh -o jsonpath='{.spec.config.passwd.users[0].sshAuthorizedKeys[0]}' --context admin --cluster crc --kubeconfig /opt/kubeconfig" level=debug msg="SSH command results: err: <nil>, output: ssh-ed25519 AAAAC3NzaC1lZDI1NTE5AAAAIIdGN9qb8ZSs1pjMFVgTrP6IFdVQ7LnHi2JknTXldztQ" level=info msg="Waiting until the user's pull secret is written to the instance disk..." level=debug msg="retry loop: attempt 0" level=debug msg="Running SSH command: <hidden>" level=debug msg="SSH command succeeded" level=debug msg="Waiting for availability of resource type 'secret'" level=debug msg="retry loop: attempt 0" level=debug msg="Running SSH command: timeout 5s oc get secret --context admin --cluster crc --kubeconfig /opt/kubeconfig" level=debug msg="SSH command results: err: <nil>, output: NAME TYPE DATA AGE\nbuilder-dockercfg-5gn6x kubernetes.io/dockercfg 1 31d\ndefault-dockercfg-5mnnm kubernetes.io/dockercfg 1 31d\ndeployer-dockercfg-psgvx kubernetes.io/dockercfg 1 31d\n" level=debug msg="NAME TYPE DATA AGE\nbuilder-dockercfg-5gn6x kubernetes.io/dockercfg 1 31d\ndefault-dockercfg-5mnnm kubernetes.io/dockercfg 1 31d\ndeployer-dockercfg-psgvx kubernetes.io/dockercfg 1 31d\n" level=debug msg="Running SSH command: <hidden>" level=debug msg="SSH command succeeded" level=debug msg="Waiting for availability of resource type 'clusterversion'" level=debug msg="retry loop: attempt 0" level=debug msg="Running SSH command: timeout 5s oc get clusterversion --context admin --cluster crc --kubeconfig /opt/kubeconfig" level=debug msg="SSH command results: err: <nil>, output: NAME VERSION AVAILABLE PROGRESSING SINCE STATUS\nversion 4.16.7 True False 32d Cluster version is 4.16.7\n" level=debug msg="NAME VERSION AVAILABLE PROGRESSING SINCE STATUS\nversion 4.16.7 True False 32d Cluster version is 4.16.7\n" level=debug msg="Running SSH command: timeout 30s oc get clusterversion version -o jsonpath=\"{['spec']['clusterID']}\" --context admin --cluster crc --kubeconfig /opt/kubeconfig" level=debug msg="SSH command results: err: <nil>, output: 89f5807d-1515-4370-a04e-fa416e5c52a7" level=debug msg="Running SSH command: ls /opt/crc/routes-controller.yaml" level=debug msg="SSH command results: err: <nil>, output: /opt/crc/routes-controller.yaml\n" level=debug msg="Running SSH command: timeout 30s oc apply -f /opt/crc/routes-controller.yaml --context admin --cluster crc --kubeconfig /opt/kubeconfig" level=debug msg="SSH command results: err: Process exited with status 124, output: " ssh command error: command : timeout 30s oc apply -f /opt/crc/routes-controller.yaml --context admin --cluster crc --kubeconfig /opt/kubeconfig err : Process exited with status 124
Install new operator: Install new operator#L1
Step executing "oc apply -f tekton-task.yaml" succeeds: command 'oc apply -f tekton-task.yaml', expected to succeed, exited with exit code: 1 Command stdout: Command stderr: Error from server (InternalError): error when creating "tekton-task.yaml": Internal error occurred: failed calling webhook "webhook.pipeline.tekton.dev": failed to call webhook: Post "https://tekton-pipelines-webhook.openshift-pipelines.svc:443/defaulting?timeout=10s": no endpoints available for service "tekton-pipelines-webhook" Error from server (InternalError): error when creating "tekton-task.yaml": Internal error occurred: failed calling webhook "webhook.pipeline.tekton.dev": failed to call webhook: Post "https://tekton-pipelines-webhook.openshift-pipelines.svc:443/defaulting?timeout=10s": no endpoints available for service "tekton-pipelines-webhook"

Artifacts

Produced during runtime
Name Size
macOS Installer (macOS-12)
91.7 MB
macOS Installer (macOS-13)
91.4 MB