2026/02/17 15:15:09 Running command:
Command env: (log-file=, also-stdout=false, redirect-stderr=true)
Run from directory: 
Executable path: /bin/openstack-cloud-controller-manager
Args (comma-delimited): /bin/openstack-cloud-controller-manager,--v=2,--cloud-config=/etc/config/cloud.conf,--cluster-name=1561c3cf-8f26-428e-a411-12d745829aa0,--cloud-provider=openstack,--use-service-account-credentials=false,--controllers=cloud-node,cloud-node-lifecycle,route,service,--bind-address=127.0.0.1
2026/02/17 15:15:09 Now listening for interrupts
I0217 15:15:09.784580      13 serving.go:386] Generated self-signed cert in-memory
I0217 15:15:10.312921      13 serving.go:386] Generated self-signed cert in-memory
W0217 15:15:10.313032      13 client_config.go:667] Neither --kubeconfig nor --master was specified.  Using the inClusterConfig.  This might not work.
I0217 15:15:10.625564      13 requestheader_controller.go:255] Loaded a new request header values for RequestHeaderAuthRequestController
I0217 15:15:10.674592      13 controllermanager.go:160] Version: v1.32.1
I0217 15:15:10.683791      13 tlsconfig.go:203] "Loaded serving cert" certName="Generated self signed cert" certDetail="\"localhost@1771341309\" [serving] validServingFor=[127.0.0.1,127.0.0.1,localhost] issuer=\"localhost-ca@1771341309\" (2026-02-17 14:15:09 +0000 UTC to 2027-02-17 14:15:09 +0000 UTC (now=2026-02-17 15:15:10.683756254 +0000 UTC))"
I0217 15:15:10.684226      13 named_certificates.go:53] "Loaded SNI cert" index=0 certName="self-signed loopback" certDetail="\"apiserver-loopback-client@1771341310\" [serving] validServingFor=[apiserver-loopback-client] issuer=\"apiserver-loopback-client-ca@1771341310\" (2026-02-17 14:15:10 +0000 UTC to 2027-02-17 14:15:10 +0000 UTC (now=2026-02-17 15:15:10.684207785 +0000 UTC))"
I0217 15:15:10.684350      13 secure_serving.go:213] Serving securely on 127.0.0.1:10258
I0217 15:15:10.684416      13 requestheader_controller.go:180] Starting RequestHeaderAuthRequestController
I0217 15:15:10.684403      13 configmap_cafile_content.go:205] "Starting controller" name="client-ca::kube-system::extension-apiserver-authentication::client-ca-file"
I0217 15:15:10.684807      13 configmap_cafile_content.go:205] "Starting controller" name="client-ca::kube-system::extension-apiserver-authentication::requestheader-client-ca-file"
I0217 15:15:10.685818      13 tlsconfig.go:243] "Starting DynamicServingCertificateController"
I0217 15:15:10.684463      13 shared_informer.go:313] Waiting for caches to sync for RequestHeaderAuthRequestController
I0217 15:15:10.684537      13 shared_informer.go:313] Waiting for caches to sync for client-ca::kube-system::extension-apiserver-authentication::client-ca-file
I0217 15:15:10.684874      13 shared_informer.go:313] Waiting for caches to sync for client-ca::kube-system::extension-apiserver-authentication::requestheader-client-ca-file
I0217 15:15:10.685751      13 leaderelection.go:257] attempting to acquire leader lease kube-system/cloud-controller-manager...
I0217 15:15:10.688361      13 reflector.go:376] Caches populated for *v1.ConfigMap from k8s.io/client-go@v0.32.7/tools/cache/reflector.go:251
I0217 15:15:10.688504      13 reflector.go:376] Caches populated for *v1.ConfigMap from k8s.io/client-go@v0.32.7/tools/cache/reflector.go:251
I0217 15:15:10.688361      13 reflector.go:376] Caches populated for *v1.ConfigMap from k8s.io/client-go@v0.32.7/tools/cache/reflector.go:251
I0217 15:15:10.729598      13 leaderelection.go:271] successfully acquired lease kube-system/cloud-controller-manager
I0217 15:15:10.730100      13 event.go:389] "Event occurred" object="kube-system/cloud-controller-manager" fieldPath="" kind="Lease" apiVersion="coordination.k8s.io/v1" type="Normal" reason="LeaderElection" message="kube-2tezr-dtj9x-6mrzd_70e01dbd-5b4e-48c2-b5cb-91dac69634b3 became leader"
I0217 15:15:10.734738      13 openstack.go:424] Setting up informers for Cloud
I0217 15:15:10.735074      13 controllermanager.go:310] Starting "cloud-node-controller"
I0217 15:15:10.736877      13 controllermanager.go:329] Started "cloud-node-controller"
I0217 15:15:10.737231      13 controllermanager.go:310] Starting "cloud-node-lifecycle-controller"
I0217 15:15:10.737603      13 controllermanager.go:329] Started "cloud-node-lifecycle-controller"
I0217 15:15:10.737746      13 controllermanager.go:310] Starting "service-lb-controller"
I0217 15:15:10.738280      13 node_lifecycle_controller.go:112] Sending events to api server
I0217 15:15:10.738393      13 node_controller.go:176] Sending events to api server.
I0217 15:15:10.740262      13 node_controller.go:185] Waiting for informer caches to sync
I0217 15:15:10.741229      13 openstack.go:373] Claiming to support LoadBalancer
I0217 15:15:10.741744      13 controllermanager.go:329] Started "service-lb-controller"
I0217 15:15:10.741867      13 controllermanager.go:310] Starting "node-route-controller"
I0217 15:15:10.742322      13 controller.go:234] Starting service controller
I0217 15:15:10.742370      13 shared_informer.go:313] Waiting for caches to sync for service
I0217 15:15:10.786512      13 shared_informer.go:320] Caches are synced for RequestHeaderAuthRequestController
I0217 15:15:10.786948      13 shared_informer.go:320] Caches are synced for client-ca::kube-system::extension-apiserver-authentication::client-ca-file
I0217 15:15:10.787889      13 tlsconfig.go:181] "Loaded client CA" index=0 certName="client-ca::kube-system::extension-apiserver-authentication::client-ca-file,client-ca::kube-system::extension-apiserver-authentication::requestheader-client-ca-file" certDetail="\"k8s-cluster\" [] issuer=\"<self>\" (2026-02-16 15:09:49 +0000 UTC to 2031-02-16 15:09:49 +0000 UTC (now=2026-02-17 15:15:10.787800165 +0000 UTC))"
I0217 15:15:10.788082      13 shared_informer.go:320] Caches are synced for client-ca::kube-system::extension-apiserver-authentication::requestheader-client-ca-file
I0217 15:15:10.789481      13 tlsconfig.go:203] "Loaded serving cert" certName="Generated self signed cert" certDetail="\"localhost@1771341309\" [serving] validServingFor=[127.0.0.1,127.0.0.1,localhost] issuer=\"localhost-ca@1771341309\" (2026-02-17 14:15:09 +0000 UTC to 2027-02-17 14:15:09 +0000 UTC (now=2026-02-17 15:15:10.789452954 +0000 UTC))"
I0217 15:15:10.789870      13 named_certificates.go:53] "Loaded SNI cert" index=0 certName="self-signed loopback" certDetail="\"apiserver-loopback-client@1771341310\" [serving] validServingFor=[apiserver-loopback-client] issuer=\"apiserver-loopback-client-ca@1771341310\" (2026-02-17 14:15:10 +0000 UTC to 2027-02-17 14:15:10 +0000 UTC (now=2026-02-17 15:15:10.789842133 +0000 UTC))"
I0217 15:15:10.790135      13 tlsconfig.go:181] "Loaded client CA" index=0 certName="client-ca::kube-system::extension-apiserver-authentication::client-ca-file,client-ca::kube-system::extension-apiserver-authentication::requestheader-client-ca-file" certDetail="\"k8s-cluster\" [] issuer=\"<self>\" (2026-02-16 15:09:49 +0000 UTC to 2031-02-16 15:09:49 +0000 UTC (now=2026-02-17 15:15:10.79011528 +0000 UTC))"
I0217 15:15:10.790204      13 tlsconfig.go:181] "Loaded client CA" index=1 certName="client-ca::kube-system::extension-apiserver-authentication::client-ca-file,client-ca::kube-system::extension-apiserver-authentication::requestheader-client-ca-file" certDetail="\"k8s-cluster\" [] issuer=\"<self>\" (2026-02-16 15:09:50 +0000 UTC to 2031-02-16 15:09:50 +0000 UTC (now=2026-02-17 15:15:10.790189792 +0000 UTC))"
I0217 15:15:10.790801      13 tlsconfig.go:203] "Loaded serving cert" certName="Generated self signed cert" certDetail="\"localhost@1771341309\" [serving] validServingFor=[127.0.0.1,127.0.0.1,localhost] issuer=\"localhost-ca@1771341309\" (2026-02-17 14:15:09 +0000 UTC to 2027-02-17 14:15:09 +0000 UTC (now=2026-02-17 15:15:10.790780817 +0000 UTC))"
I0217 15:15:10.791244      13 named_certificates.go:53] "Loaded SNI cert" index=0 certName="self-signed loopback" certDetail="\"apiserver-loopback-client@1771341310\" [serving] validServingFor=[apiserver-loopback-client] issuer=\"apiserver-loopback-client-ca@1771341310\" (2026-02-17 14:15:10 +0000 UTC to 2027-02-17 14:15:10 +0000 UTC (now=2026-02-17 15:15:10.791222897 +0000 UTC))"
W0217 15:15:10.793675      13 openstack.go:408] Error initialising Routes support: router-id not set in cloud provider config
W0217 15:15:10.793747      13 core.go:111] --configure-cloud-routes is set, but cloud provider does not support routes. Will not configure cloud provider routes.
W0217 15:15:10.793773      13 controllermanager.go:317] Skipping "node-route-controller"
I0217 15:15:10.798980      13 reflector.go:376] Caches populated for *v1.Service from k8s.io/client-go@v0.32.7/tools/cache/reflector.go:251
I0217 15:15:10.799794      13 reflector.go:376] Caches populated for *v1.Node from k8s.io/client-go@v0.32.7/tools/cache/reflector.go:251
I0217 15:15:10.841203      13 node_controller.go:271] Update 2 nodes status took 144.354µs.
I0217 15:15:10.841213      13 node_controller.go:429] Initializing node kube-2tezr-default-worker-zm2gj-6c8kc-mfs69 with cloud provider
I0217 15:15:10.842533      13 shared_informer.go:320] Caches are synced for service
I0217 15:15:10.842587      13 controller.go:722] Syncing backends for all LB services.
I0217 15:15:10.842600      13 controller.go:726] Successfully updated 0 out of 0 load balancers to direct traffic to the updated set of nodes
I0217 15:15:10.842676      13 controller.go:722] Syncing backends for all LB services.
I0217 15:15:10.842689      13 controller.go:726] Successfully updated 0 out of 0 load balancers to direct traffic to the updated set of nodes
I0217 15:15:11.343670      13 node_controller.go:512] Adding node label from cloud provider: beta.kubernetes.io/instance-type=m1.large
I0217 15:15:11.343712      13 node_controller.go:513] Adding node label from cloud provider: node.kubernetes.io/instance-type=m1.large
I0217 15:15:11.343718      13 node_controller.go:524] Adding node label from cloud provider: failure-domain.beta.kubernetes.io/zone=nova
I0217 15:15:11.343724      13 node_controller.go:525] Adding node label from cloud provider: topology.kubernetes.io/zone=nova
I0217 15:15:11.343730      13 node_controller.go:535] Adding node label from cloud provider: failure-domain.beta.kubernetes.io/region=RegionOne
I0217 15:15:11.343736      13 node_controller.go:536] Adding node label from cloud provider: topology.kubernetes.io/region=RegionOne
I0217 15:15:11.372889      13 controller.go:722] Syncing backends for all LB services.
I0217 15:15:11.372965      13 controller.go:726] Successfully updated 0 out of 0 load balancers to direct traffic to the updated set of nodes
I0217 15:15:11.437016      13 node_controller.go:474] Successfully initialized node kube-2tezr-default-worker-zm2gj-6c8kc-mfs69 with cloud provider
I0217 15:15:11.437517      13 node_controller.go:429] Initializing node kube-2tezr-dtj9x-6mrzd with cloud provider
I0217 15:15:11.437811      13 event.go:389] "Event occurred" object="kube-2tezr-default-worker-zm2gj-6c8kc-mfs69" fieldPath="" kind="Node" apiVersion="v1" type="Normal" reason="Synced" message="Node synced successfully"
I0217 15:15:11.898512      13 node_controller.go:512] Adding node label from cloud provider: beta.kubernetes.io/instance-type=m1.large
I0217 15:15:11.898732      13 node_controller.go:513] Adding node label from cloud provider: node.kubernetes.io/instance-type=m1.large
I0217 15:15:11.898762      13 node_controller.go:524] Adding node label from cloud provider: failure-domain.beta.kubernetes.io/zone=nova
I0217 15:15:11.899180      13 node_controller.go:525] Adding node label from cloud provider: topology.kubernetes.io/zone=nova
I0217 15:15:11.899352      13 node_controller.go:535] Adding node label from cloud provider: failure-domain.beta.kubernetes.io/region=RegionOne
I0217 15:15:11.899562      13 node_controller.go:536] Adding node label from cloud provider: topology.kubernetes.io/region=RegionOne
I0217 15:15:11.920738      13 controller.go:722] Syncing backends for all LB services.
I0217 15:15:11.920775      13 controller.go:726] Successfully updated 0 out of 0 load balancers to direct traffic to the updated set of nodes
I0217 15:15:12.055720      13 node_controller.go:474] Successfully initialized node kube-2tezr-dtj9x-6mrzd with cloud provider
I0217 15:15:12.055966      13 event.go:389] "Event occurred" object="kube-2tezr-dtj9x-6mrzd" fieldPath="" kind="Node" apiVersion="v1" type="Normal" reason="Synced" message="Node synced successfully"
I0217 15:15:12.864805      13 node_controller.go:429] Initializing node kube-2tezr-default-worker-zm2gj-6c8kc-5szpv with cloud provider
I0217 15:15:12.865075      13 controller.go:722] Syncing backends for all LB services.
I0217 15:15:12.865098      13 controller.go:726] Successfully updated 0 out of 0 load balancers to direct traffic to the updated set of nodes
I0217 15:15:13.345379      13 node_controller.go:512] Adding node label from cloud provider: beta.kubernetes.io/instance-type=m1.large
I0217 15:15:13.345407      13 node_controller.go:513] Adding node label from cloud provider: node.kubernetes.io/instance-type=m1.large
I0217 15:15:13.345417      13 node_controller.go:524] Adding node label from cloud provider: failure-domain.beta.kubernetes.io/zone=nova
I0217 15:15:13.345425      13 node_controller.go:525] Adding node label from cloud provider: topology.kubernetes.io/zone=nova
I0217 15:15:13.345435      13 node_controller.go:535] Adding node label from cloud provider: failure-domain.beta.kubernetes.io/region=RegionOne
I0217 15:15:13.345445      13 node_controller.go:536] Adding node label from cloud provider: topology.kubernetes.io/region=RegionOne
I0217 15:15:13.375303      13 controller.go:722] Syncing backends for all LB services.
I0217 15:15:13.375356      13 controller.go:726] Successfully updated 0 out of 0 load balancers to direct traffic to the updated set of nodes
I0217 15:15:13.415893      13 node_controller.go:474] Successfully initialized node kube-2tezr-default-worker-zm2gj-6c8kc-5szpv with cloud provider
I0217 15:15:13.415983      13 event.go:389] "Event occurred" object="kube-2tezr-default-worker-zm2gj-6c8kc-5szpv" fieldPath="" kind="Node" apiVersion="v1" type="Normal" reason="Synced" message="Node synced successfully"
I0217 15:16:40.977887      13 controller.go:722] Syncing backends for all LB services.
I0217 15:16:40.977993      13 controller.go:726] Successfully updated 0 out of 0 load balancers to direct traffic to the updated set of nodes
I0217 15:16:41.076248      13 controller.go:722] Syncing backends for all LB services.
I0217 15:16:41.076295      13 controller.go:726] Successfully updated 0 out of 0 load balancers to direct traffic to the updated set of nodes
I0217 15:20:12.070187      13 node_controller.go:271] Update 3 nodes status took 1.228695759s.
I0217 15:25:13.170724      13 node_controller.go:271] Update 3 nodes status took 1.100187993s.
I0217 15:30:14.314742      13 node_controller.go:271] Update 3 nodes status took 1.127585131s.
I0217 15:35:15.384728      13 node_controller.go:271] Update 3 nodes status took 1.069448672s.
I0217 15:40:16.594412      13 node_controller.go:271] Update 3 nodes status took 1.208909086s.
