I0915 22:16:46.564713 1 serving.go:348] Generated self-signed cert in-memory I0915 22:16:46.986447 1 controllermanager.go:189] "Starting" version="v1.28.13" I0915 22:16:46.986468 1 controllermanager.go:191] "Golang settings" GOGC="" GOMAXPROCS="" GOTRACEBACK="" I0915 22:16:46.988310 1 dynamic_cafile_content.go:157] "Starting controller" name="request-header::/etc/kubernetes/pki/front-proxy-ca.crt" I0915 22:16:46.988471 1 dynamic_cafile_content.go:157] "Starting controller" name="client-ca-bundle::/etc/kubernetes/pki/ca.crt" I0915 22:16:46.989340 1 secure_serving.go:213] Serving securely on [::]:10257 I0915 22:16:46.989985 1 leaderelection.go:250] attempting to acquire leader lease kube-system/kube-controller-manager... I0915 22:16:46.990013 1 tlsconfig.go:240] "Starting DynamicServingCertificateController" E0915 22:16:47.868479 1 leaderelection.go:332] error retrieving resource lock kube-system/kube-controller-manager: leases.coordination.k8s.io "kube-controller-manager" is forbidden: User "system:kube-controller-manager" cannot get resource "leases" in API group "coordination.k8s.io" in the namespace "kube-system" I0915 22:16:51.337629 1 leaderelection.go:260] successfully acquired lease kube-system/kube-controller-manager I0915 22:16:51.337858 1 event.go:307] "Event occurred" object="kube-system/kube-controller-manager" fieldPath="" kind="Lease" apiVersion="coordination.k8s.io/v1" type="Normal" reason="LeaderElection" message="instance_23a829ab-4b45-4d83-a904-b4a9380313c8 became leader" I0915 22:16:51.344825 1 shared_informer.go:311] Waiting for caches to sync for tokens I0915 22:16:51.352290 1 controllermanager.go:642] "Started controller" controller="daemonset-controller" I0915 22:16:51.352432 1 daemon_controller.go:291] "Starting daemon sets controller" I0915 22:16:51.352450 1 shared_informer.go:311] Waiting for caches to sync for daemon sets I0915 22:16:51.358897 1 controllermanager.go:642] "Started controller" controller="deployment-controller" I0915 22:16:51.358994 1 deployment_controller.go:168] "Starting controller" controller="deployment" I0915 22:16:51.359009 1 shared_informer.go:311] Waiting for caches to sync for deployment I0915 22:16:51.364815 1 controllermanager.go:642] "Started controller" controller="replicaset-controller" I0915 22:16:51.364934 1 replica_set.go:214] "Starting controller" name="replicaset" I0915 22:16:51.364947 1 shared_informer.go:311] Waiting for caches to sync for ReplicaSet I0915 22:16:51.371111 1 controllermanager.go:642] "Started controller" controller="certificatesigningrequest-cleaner-controller" I0915 22:16:51.371191 1 cleaner.go:83] "Starting CSR cleaner controller" I0915 22:16:51.380422 1 controllermanager.go:642] "Started controller" controller="ttl-controller" I0915 22:16:51.380611 1 ttl_controller.go:124] "Starting TTL controller" I0915 22:16:51.380623 1 shared_informer.go:311] Waiting for caches to sync for TTL I0915 22:16:51.392690 1 node_lifecycle_controller.go:431] "Controller will reconcile labels" I0915 22:16:51.392732 1 controllermanager.go:642] "Started controller" controller="node-lifecycle-controller" I0915 22:16:51.392754 1 core.go:224] "Will not configure cloud provider routes for allocate-node-cidrs" CIDRs=false routes=true I0915 22:16:51.392764 1 controllermanager.go:620] "Warning: skipping controller" controller="node-route-controller" I0915 22:16:51.392944 1 node_lifecycle_controller.go:465] "Sending events to api server" I0915 22:16:51.392965 1 node_lifecycle_controller.go:476] "Starting node controller" I0915 22:16:51.392972 1 shared_informer.go:311] Waiting for caches to sync for taint I0915 22:16:51.401528 1 controllermanager.go:642] "Started controller" controller="replicationcontroller-controller" I0915 22:16:51.401777 1 replica_set.go:214] "Starting controller" name="replicationcontroller" I0915 22:16:51.401789 1 shared_informer.go:311] Waiting for caches to sync for ReplicationController I0915 22:16:51.412490 1 controllermanager.go:642] "Started controller" controller="job-controller" I0915 22:16:51.412637 1 job_controller.go:226] "Starting job controller" I0915 22:16:51.412665 1 shared_informer.go:311] Waiting for caches to sync for job I0915 22:16:51.423115 1 controllermanager.go:642] "Started controller" controller="disruption-controller" I0915 22:16:51.423185 1 disruption.go:433] "Sending events to api server." I0915 22:16:51.423235 1 disruption.go:444] "Starting disruption controller" I0915 22:16:51.423241 1 shared_informer.go:311] Waiting for caches to sync for disruption I0915 22:16:51.442517 1 controllermanager.go:642] "Started controller" controller="statefulset-controller" I0915 22:16:51.442578 1 stateful_set.go:163] "Starting stateful set controller" I0915 22:16:51.442720 1 shared_informer.go:311] Waiting for caches to sync for stateful set I0915 22:16:51.445434 1 shared_informer.go:318] Caches are synced for tokens I0915 22:16:51.593689 1 controllermanager.go:642] "Started controller" controller="persistentvolumeclaim-protection-controller" I0915 22:16:51.593757 1 pvc_protection_controller.go:102] "Starting PVC protection controller" I0915 22:16:51.593801 1 shared_informer.go:311] Waiting for caches to sync for PVC protection I0915 22:16:51.853729 1 controllermanager.go:642] "Started controller" controller="namespace-controller" I0915 22:16:51.853788 1 namespace_controller.go:197] "Starting namespace controller" I0915 22:16:51.853796 1 shared_informer.go:311] Waiting for caches to sync for namespace I0915 22:16:51.994315 1 controllermanager.go:642] "Started controller" controller="bootstrap-signer-controller" I0915 22:16:51.994396 1 shared_informer.go:311] Waiting for caches to sync for bootstrap_signer I0915 22:16:52.143383 1 controllermanager.go:642] "Started controller" controller="persistentvolume-protection-controller" I0915 22:16:52.143452 1 pv_protection_controller.go:78] "Starting PV protection controller" I0915 22:16:52.143460 1 shared_informer.go:311] Waiting for caches to sync for PV protection I0915 22:16:52.391825 1 controllermanager.go:642] "Started controller" controller="garbage-collector-controller" I0915 22:16:52.392080 1 garbagecollector.go:155] "Starting controller" controller="garbagecollector" I0915 22:16:52.392125 1 shared_informer.go:311] Waiting for caches to sync for garbage collector I0915 22:16:52.392154 1 graph_builder.go:294] "Running" component="GraphBuilder" I0915 22:16:52.647690 1 controllermanager.go:642] "Started controller" controller="endpointslice-mirroring-controller" I0915 22:16:52.648072 1 endpointslicemirroring_controller.go:223] "Starting EndpointSliceMirroring controller" I0915 22:16:52.648157 1 shared_informer.go:311] Waiting for caches to sync for endpoint_slice_mirroring I0915 22:16:52.794266 1 controllermanager.go:642] "Started controller" controller="cronjob-controller" I0915 22:16:52.794364 1 cronjob_controllerv2.go:139] "Starting cronjob controller v2" I0915 22:16:52.794388 1 shared_informer.go:311] Waiting for caches to sync for cronjob I0915 22:16:52.943737 1 controllermanager.go:642] "Started controller" controller="token-cleaner-controller" I0915 22:16:52.943779 1 controllermanager.go:620] "Warning: skipping controller" controller="node-ipam-controller" I0915 22:16:52.943867 1 tokencleaner.go:112] "Starting token cleaner controller" I0915 22:16:52.943879 1 shared_informer.go:311] Waiting for caches to sync for token_cleaner I0915 22:16:52.943891 1 shared_informer.go:318] Caches are synced for token_cleaner I0915 22:16:53.094301 1 controllermanager.go:642] "Started controller" controller="persistentvolume-binder-controller" I0915 22:16:53.094552 1 pv_controller_base.go:319] "Starting persistent volume controller" I0915 22:16:53.094587 1 shared_informer.go:311] Waiting for caches to sync for persistent volume I0915 22:16:53.242671 1 controllermanager.go:642] "Started controller" controller="clusterrole-aggregation-controller" I0915 22:16:53.242724 1 clusterroleaggregation_controller.go:189] "Starting ClusterRoleAggregator controller" I0915 22:16:53.242732 1 shared_informer.go:311] Waiting for caches to sync for ClusterRoleAggregator I0915 22:16:53.394412 1 controllermanager.go:642] "Started controller" controller="ttl-after-finished-controller" I0915 22:16:53.394512 1 ttlafterfinished_controller.go:109] "Starting TTL after finished controller" I0915 22:16:53.394529 1 shared_informer.go:311] Waiting for caches to sync for TTL after finished I0915 22:16:53.543528 1 controllermanager.go:642] "Started controller" controller="endpointslice-controller" I0915 22:16:53.543955 1 endpointslice_controller.go:264] "Starting endpoint slice controller" I0915 22:16:53.544013 1 shared_informer.go:311] Waiting for caches to sync for endpoint_slice I0915 22:16:53.697349 1 controllermanager.go:642] "Started controller" controller="ephemeral-volume-controller" I0915 22:16:53.697423 1 controller.go:169] "Starting ephemeral volume controller" I0915 22:16:53.697433 1 shared_informer.go:311] Waiting for caches to sync for ephemeral I0915 22:16:53.741684 1 controllermanager.go:642] "Started controller" controller="certificatesigningrequest-approving-controller" I0915 22:16:53.741718 1 certificate_controller.go:115] "Starting certificate controller" name="csrapproving" I0915 22:16:53.741725 1 shared_informer.go:311] Waiting for caches to sync for certificate-csrapproving E0915 22:16:53.791588 1 core.go:213] "Failed to start cloud node lifecycle controller" err="no cloud provider provided" I0915 22:16:53.791626 1 controllermanager.go:620] "Warning: skipping controller" controller="cloud-node-lifecycle-controller" I0915 22:16:53.943693 1 controllermanager.go:642] "Started controller" controller="pod-garbage-collector-controller" I0915 22:16:53.943795 1 gc_controller.go:101] "Starting GC controller" I0915 22:16:53.943809 1 shared_informer.go:311] Waiting for caches to sync for GC I0915 22:16:54.092973 1 controllermanager.go:642] "Started controller" controller="serviceaccount-controller" I0915 22:16:54.093065 1 serviceaccounts_controller.go:111] "Starting service account controller" I0915 22:16:54.093079 1 shared_informer.go:311] Waiting for caches to sync for service account I0915 22:16:54.141850 1 certificate_controller.go:115] "Starting certificate controller" name="csrsigning-kubelet-serving" I0915 22:16:54.141877 1 shared_informer.go:311] Waiting for caches to sync for certificate-csrsigning-kubelet-serving I0915 22:16:54.141916 1 dynamic_serving_content.go:132] "Starting controller" name="csr-controller::/etc/kubernetes/pki/ca.crt::/etc/kubernetes/pki/ca.key" I0915 22:16:54.142421 1 certificate_controller.go:115] "Starting certificate controller" name="csrsigning-kubelet-client" I0915 22:16:54.142432 1 shared_informer.go:311] Waiting for caches to sync for certificate-csrsigning-kubelet-client I0915 22:16:54.142464 1 dynamic_serving_content.go:132] "Starting controller" name="csr-controller::/etc/kubernetes/pki/ca.crt::/etc/kubernetes/pki/ca.key" I0915 22:16:54.143002 1 certificate_controller.go:115] "Starting certificate controller" name="csrsigning-kube-apiserver-client" I0915 22:16:54.143017 1 shared_informer.go:311] Waiting for caches to sync for certificate-csrsigning-kube-apiserver-client I0915 22:16:54.143035 1 dynamic_serving_content.go:132] "Starting controller" name="csr-controller::/etc/kubernetes/pki/ca.crt::/etc/kubernetes/pki/ca.key" I0915 22:16:54.143552 1 controllermanager.go:642] "Started controller" controller="certificatesigningrequest-signing-controller" I0915 22:16:54.143586 1 certificate_controller.go:115] "Starting certificate controller" name="csrsigning-legacy-unknown" I0915 22:16:54.143596 1 shared_informer.go:311] Waiting for caches to sync for certificate-csrsigning-legacy-unknown I0915 22:16:54.143611 1 dynamic_serving_content.go:132] "Starting controller" name="csr-controller::/etc/kubernetes/pki/ca.crt::/etc/kubernetes/pki/ca.key" I0915 22:16:54.450733 1 resource_quota_monitor.go:224] "QuotaMonitor created object count evaluator" resource="podtemplates" I0915 22:16:54.450793 1 resource_quota_monitor.go:224] "QuotaMonitor created object count evaluator" resource="deployments.apps" I0915 22:16:54.450839 1 resource_quota_monitor.go:224] "QuotaMonitor created object count evaluator" resource="controllerrevisions.apps" I0915 22:16:54.450910 1 resource_quota_monitor.go:224] "QuotaMonitor created object count evaluator" resource="networkpolicies.networking.k8s.io" W0915 22:16:54.450932 1 shared_informer.go:593] resyncPeriod 17h18m12.113004963s is smaller than resyncCheckPeriod 21h57m24.216522688s and the informer has already started. Changing it to 21h57m24.216522688s I0915 22:16:54.450993 1 resource_quota_monitor.go:224] "QuotaMonitor created object count evaluator" resource="replicasets.apps" I0915 22:16:54.451050 1 resource_quota_monitor.go:224] "QuotaMonitor created object count evaluator" resource="horizontalpodautoscalers.autoscaling" I0915 22:16:54.451090 1 resource_quota_monitor.go:224] "QuotaMonitor created object count evaluator" resource="roles.rbac.authorization.k8s.io" I0915 22:16:54.451159 1 resource_quota_monitor.go:224] "QuotaMonitor created object count evaluator" resource="daemonsets.apps" I0915 22:16:54.451199 1 resource_quota_monitor.go:224] "QuotaMonitor created object count evaluator" resource="cronjobs.batch" I0915 22:16:54.451244 1 resource_quota_monitor.go:224] "QuotaMonitor created object count evaluator" resource="ingresses.networking.k8s.io" I0915 22:16:54.451271 1 resource_quota_monitor.go:224] "QuotaMonitor created object count evaluator" resource="leases.coordination.k8s.io" I0915 22:16:54.451332 1 resource_quota_monitor.go:224] "QuotaMonitor created object count evaluator" resource="rolebindings.rbac.authorization.k8s.io" I0915 22:16:54.451380 1 resource_quota_monitor.go:224] "QuotaMonitor created object count evaluator" resource="csistoragecapacities.storage.k8s.io" I0915 22:16:54.451419 1 resource_quota_monitor.go:224] "QuotaMonitor created object count evaluator" resource="statefulsets.apps" I0915 22:16:54.451469 1 resource_quota_monitor.go:224] "QuotaMonitor created object count evaluator" resource="poddisruptionbudgets.policy" W0915 22:16:54.451514 1 shared_informer.go:593] resyncPeriod 14h42m46.931832476s is smaller than resyncCheckPeriod 21h57m24.216522688s and the informer has already started. Changing it to 21h57m24.216522688s I0915 22:16:54.451640 1 resource_quota_monitor.go:224] "QuotaMonitor created object count evaluator" resource="serviceaccounts" I0915 22:16:54.451689 1 resource_quota_monitor.go:224] "QuotaMonitor created object count evaluator" resource="endpoints" I0915 22:16:54.451737 1 resource_quota_monitor.go:224] "QuotaMonitor created object count evaluator" resource="limitranges" I0915 22:16:54.451759 1 resource_quota_monitor.go:224] "QuotaMonitor created object count evaluator" resource="jobs.batch" I0915 22:16:54.451790 1 resource_quota_monitor.go:224] "QuotaMonitor created object count evaluator" resource="endpointslices.discovery.k8s.io" I0915 22:16:54.451820 1 controllermanager.go:642] "Started controller" controller="resourcequota-controller" I0915 22:16:54.451873 1 resource_quota_controller.go:294] "Starting resource quota controller" I0915 22:16:54.451894 1 shared_informer.go:311] Waiting for caches to sync for resource quota I0915 22:16:54.451926 1 resource_quota_monitor.go:305] "QuotaMonitor running" I0915 22:16:54.593857 1 controllermanager.go:642] "Started controller" controller="persistentvolume-expander-controller" I0915 22:16:54.593924 1 expand_controller.go:328] "Starting expand controller" I0915 22:16:54.593933 1 shared_informer.go:311] Waiting for caches to sync for expand I0915 22:16:54.893901 1 controllermanager.go:642] "Started controller" controller="horizontal-pod-autoscaler-controller" I0915 22:16:54.894010 1 horizontal.go:200] "Starting HPA controller" I0915 22:16:54.894025 1 shared_informer.go:311] Waiting for caches to sync for HPA E0915 22:16:55.045550 1 core.go:92] "Failed to start service controller" err="WARNING: no cloud provider provided, services of type LoadBalancer will fail" I0915 22:16:55.045618 1 controllermanager.go:620] "Warning: skipping controller" controller="service-lb-controller" I0915 22:16:55.199310 1 controllermanager.go:642] "Started controller" controller="persistentvolume-attach-detach-controller" I0915 22:16:55.199663 1 attach_detach_controller.go:337] "Starting attach detach controller" I0915 22:16:55.199710 1 shared_informer.go:311] Waiting for caches to sync for attach detach I0915 22:16:55.343755 1 controllermanager.go:642] "Started controller" controller="root-ca-certificate-publisher-controller" I0915 22:16:55.343825 1 publisher.go:102] "Starting root CA cert publisher controller" I0915 22:16:55.343833 1 shared_informer.go:311] Waiting for caches to sync for crt configmap I0915 22:16:55.495685 1 controllermanager.go:642] "Started controller" controller="endpoints-controller" I0915 22:16:55.495859 1 endpoints_controller.go:177] "Starting endpoint controller" I0915 22:16:55.495889 1 shared_informer.go:311] Waiting for caches to sync for endpoint I0915 22:16:55.499471 1 shared_informer.go:311] Waiting for caches to sync for resource quota I0915 22:16:55.517390 1 actual_state_of_world.go:547] "Failed to update statusUpdateNeeded field in actual state of world" err="Failed to set statusUpdateNeeded to needed true, because nodeName=\"instance\" does not exist" I0915 22:16:55.523664 1 shared_informer.go:318] Caches are synced for disruption I0915 22:16:55.528190 1 shared_informer.go:311] Waiting for caches to sync for garbage collector I0915 22:16:55.542298 1 shared_informer.go:318] Caches are synced for certificate-csrsigning-kubelet-serving I0915 22:16:55.542349 1 shared_informer.go:318] Caches are synced for certificate-csrapproving I0915 22:16:55.542481 1 shared_informer.go:318] Caches are synced for certificate-csrsigning-kubelet-client I0915 22:16:55.542838 1 shared_informer.go:318] Caches are synced for ClusterRoleAggregator I0915 22:16:55.543270 1 shared_informer.go:318] Caches are synced for certificate-csrsigning-kube-apiserver-client I0915 22:16:55.543718 1 shared_informer.go:318] Caches are synced for PV protection I0915 22:16:55.543750 1 shared_informer.go:318] Caches are synced for certificate-csrsigning-legacy-unknown I0915 22:16:55.543860 1 shared_informer.go:318] Caches are synced for GC I0915 22:16:55.543991 1 shared_informer.go:318] Caches are synced for crt configmap I0915 22:16:55.554144 1 shared_informer.go:318] Caches are synced for namespace I0915 22:16:55.559514 1 shared_informer.go:318] Caches are synced for deployment I0915 22:16:55.565832 1 shared_informer.go:318] Caches are synced for ReplicaSet I0915 22:16:55.581310 1 shared_informer.go:318] Caches are synced for TTL I0915 22:16:55.593326 1 shared_informer.go:318] Caches are synced for service account I0915 22:16:55.594284 1 shared_informer.go:318] Caches are synced for PVC protection I0915 22:16:55.594323 1 shared_informer.go:318] Caches are synced for HPA I0915 22:16:55.594384 1 shared_informer.go:318] Caches are synced for expand I0915 22:16:55.594553 1 shared_informer.go:318] Caches are synced for cronjob I0915 22:16:55.594662 1 shared_informer.go:318] Caches are synced for TTL after finished I0915 22:16:55.594731 1 shared_informer.go:318] Caches are synced for bootstrap_signer I0915 22:16:55.594734 1 shared_informer.go:318] Caches are synced for persistent volume I0915 22:16:55.598608 1 shared_informer.go:318] Caches are synced for ephemeral I0915 22:16:55.599853 1 shared_informer.go:318] Caches are synced for attach detach I0915 22:16:55.602645 1 shared_informer.go:318] Caches are synced for ReplicationController I0915 22:16:55.612913 1 shared_informer.go:318] Caches are synced for job I0915 22:16:55.644274 1 shared_informer.go:318] Caches are synced for endpoint_slice I0915 22:16:55.648727 1 shared_informer.go:318] Caches are synced for endpoint_slice_mirroring I0915 22:16:55.693892 1 shared_informer.go:318] Caches are synced for taint I0915 22:16:55.694038 1 node_lifecycle_controller.go:1225] "Initializing eviction metric for zone" zone="" I0915 22:16:55.694062 1 taint_manager.go:205] "Starting NoExecuteTaintManager" I0915 22:16:55.694191 1 node_lifecycle_controller.go:877] "Missing timestamp for Node. Assuming now as a timestamp" node="instance" I0915 22:16:55.694267 1 node_lifecycle_controller.go:1029] "Controller detected that all Nodes are not-Ready. Entering master disruption mode" I0915 22:16:55.694506 1 event.go:307] "Event occurred" object="instance" fieldPath="" kind="Node" apiVersion="v1" type="Normal" reason="RegisteredNode" message="Node instance event: Registered Node instance in Controller" I0915 22:16:55.694742 1 taint_manager.go:210] "Sending events to api server" I0915 22:16:55.696069 1 shared_informer.go:318] Caches are synced for endpoint I0915 22:16:55.743291 1 shared_informer.go:318] Caches are synced for stateful set I0915 22:16:55.752778 1 shared_informer.go:318] Caches are synced for daemon sets I0915 22:16:55.752994 1 shared_informer.go:318] Caches are synced for resource quota I0915 22:16:55.799567 1 shared_informer.go:318] Caches are synced for resource quota I0915 22:16:56.129351 1 shared_informer.go:318] Caches are synced for garbage collector I0915 22:16:56.193313 1 shared_informer.go:318] Caches are synced for garbage collector I0915 22:16:56.193351 1 garbagecollector.go:166] "All resource monitors have synced. Proceeding to collect garbage" I0915 22:16:56.202854 1 event.go:307] "Event occurred" object="kube-system/coredns" fieldPath="" kind="Deployment" apiVersion="apps/v1" type="Normal" reason="ScalingReplicaSet" message="Scaled up replica set coredns-7c96b6546b to 2" I0915 22:16:56.507824 1 event.go:307] "Event occurred" object="kube-system/kube-vip-instance" fieldPath="" kind="Pod" apiVersion="v1" type="Warning" reason="NodeNotReady" message="Node is not ready" I0915 22:16:56.668782 1 event.go:307] "Event occurred" object="kube-system/kube-proxy" fieldPath="" kind="DaemonSet" apiVersion="apps/v1" type="Normal" reason="SuccessfulCreate" message="Created pod: kube-proxy-52cl8" I0915 22:16:56.743930 1 event.go:307] "Event occurred" object="kube-system/coredns-7c96b6546b" fieldPath="" kind="ReplicaSet" apiVersion="apps/v1" type="Normal" reason="SuccessfulCreate" message="Created pod: coredns-7c96b6546b-fftj4" I0915 22:16:56.754779 1 event.go:307] "Event occurred" object="kube-system/coredns-7c96b6546b" fieldPath="" kind="ReplicaSet" apiVersion="apps/v1" type="Normal" reason="SuccessfulCreate" message="Created pod: coredns-7c96b6546b-zjllm" I0915 22:16:56.771749 1 replica_set.go:676] "Finished syncing" kind="ReplicaSet" key="kube-system/coredns-7c96b6546b" duration="569.374909ms" I0915 22:16:56.793398 1 replica_set.go:676] "Finished syncing" kind="ReplicaSet" key="kube-system/coredns-7c96b6546b" duration="21.577529ms" I0915 22:16:56.793505 1 replica_set.go:676] "Finished syncing" kind="ReplicaSet" key="kube-system/coredns-7c96b6546b" duration="72.573µs" I0915 22:16:56.793552 1 replica_set.go:676] "Finished syncing" kind="ReplicaSet" key="kube-system/coredns-7c96b6546b" duration="21.4µs" I0915 22:17:10.498982 1 event.go:307] "Event occurred" object="kube-system/coredns" fieldPath="" kind="Deployment" apiVersion="apps/v1" type="Normal" reason="ScalingReplicaSet" message="Scaled up replica set coredns-67659f764b to 1" I0915 22:17:10.506029 1 event.go:307] "Event occurred" object="kube-system/coredns-67659f764b" fieldPath="" kind="ReplicaSet" apiVersion="apps/v1" type="Normal" reason="SuccessfulCreate" message="Created pod: coredns-67659f764b-gg8tb" I0915 22:17:10.521966 1 replica_set.go:676] "Finished syncing" kind="ReplicaSet" key="kube-system/coredns-67659f764b" duration="23.285734ms" I0915 22:17:10.529642 1 event.go:307] "Event occurred" object="kube-system/coredns" fieldPath="" kind="Deployment" apiVersion="apps/v1" type="Normal" reason="ScalingReplicaSet" message="Scaled down replica set coredns-7c96b6546b to 1 from 2" I0915 22:17:10.543500 1 replica_set.go:676] "Finished syncing" kind="ReplicaSet" key="kube-system/coredns-67659f764b" duration="21.473622ms" I0915 22:17:10.544534 1 event.go:307] "Event occurred" object="kube-system/coredns-7c96b6546b" fieldPath="" kind="ReplicaSet" apiVersion="apps/v1" type="Normal" reason="SuccessfulDelete" message="Deleted pod: coredns-7c96b6546b-fftj4" I0915 22:17:10.560987 1 replica_set.go:676] "Finished syncing" kind="ReplicaSet" key="kube-system/coredns-7c96b6546b" duration="31.25539ms" I0915 22:17:10.563343 1 replica_set.go:676] "Finished syncing" kind="ReplicaSet" key="kube-system/coredns-67659f764b" duration="19.783395ms" I0915 22:17:10.563581 1 replica_set.go:676] "Finished syncing" kind="ReplicaSet" key="kube-system/coredns-67659f764b" duration="107.964µs" I0915 22:17:10.569952 1 event.go:307] "Event occurred" object="kube-system/coredns" fieldPath="" kind="Deployment" apiVersion="apps/v1" type="Normal" reason="ScalingReplicaSet" message="Scaled up replica set coredns-67659f764b to 2 from 1" I0915 22:17:10.574541 1 replica_set.go:676] "Finished syncing" kind="ReplicaSet" key="kube-system/coredns-7c96b6546b" duration="13.259326ms" I0915 22:17:10.574590 1 replica_set.go:676] "Finished syncing" kind="ReplicaSet" key="kube-system/coredns-7c96b6546b" duration="23.81µs" I0915 22:17:10.580237 1 event.go:307] "Event occurred" object="kube-system/coredns-67659f764b" fieldPath="" kind="ReplicaSet" apiVersion="apps/v1" type="Normal" reason="SuccessfulCreate" message="Created pod: coredns-67659f764b-w4tqz" I0915 22:17:10.595583 1 replica_set.go:676] "Finished syncing" kind="ReplicaSet" key="kube-system/coredns-67659f764b" duration="24.819064ms" I0915 22:17:10.604740 1 replica_set.go:676] "Finished syncing" kind="ReplicaSet" key="kube-system/coredns-67659f764b" duration="9.083346ms" I0915 22:17:10.604878 1 replica_set.go:676] "Finished syncing" kind="ReplicaSet" key="kube-system/coredns-67659f764b" duration="81.602µs" I0915 22:17:23.317560 1 event.go:307] "Event occurred" object="kube-system/cilium-operator" fieldPath="" kind="Deployment" apiVersion="apps/v1" type="Normal" reason="ScalingReplicaSet" message="Scaled up replica set cilium-operator-869df985b8 to 1" I0915 22:17:23.327184 1 event.go:307] "Event occurred" object="kube-system/cilium" fieldPath="" kind="DaemonSet" apiVersion="apps/v1" type="Normal" reason="SuccessfulCreate" message="Created pod: cilium-sgf8k" I0915 22:17:23.330911 1 event.go:307] "Event occurred" object="kube-system/cilium-operator-869df985b8" fieldPath="" kind="ReplicaSet" apiVersion="apps/v1" type="Normal" reason="SuccessfulCreate" message="Created pod: cilium-operator-869df985b8-gwf5b" I0915 22:17:23.352099 1 replica_set.go:676] "Finished syncing" kind="ReplicaSet" key="kube-system/cilium-operator-869df985b8" duration="33.883055ms" I0915 22:17:23.378389 1 replica_set.go:676] "Finished syncing" kind="ReplicaSet" key="kube-system/cilium-operator-869df985b8" duration="26.220654ms" I0915 22:17:23.378605 1 replica_set.go:676] "Finished syncing" kind="ReplicaSet" key="kube-system/cilium-operator-869df985b8" duration="88.173µs" I0915 22:17:23.390045 1 replica_set.go:676] "Finished syncing" kind="ReplicaSet" key="kube-system/cilium-operator-869df985b8" duration="184.806µs" I0915 22:17:25.816436 1 resource_quota_monitor.go:224] "QuotaMonitor created object count evaluator" resource="tcproutes.gateway.networking.k8s.io" I0915 22:17:25.816469 1 resource_quota_monitor.go:224] "QuotaMonitor created object count evaluator" resource="xbackendtrafficpolicies.gateway.networking.x-k8s.io" I0915 22:17:25.816507 1 resource_quota_monitor.go:224] "QuotaMonitor created object count evaluator" resource="grpcroutes.gateway.networking.k8s.io" I0915 22:17:25.816531 1 resource_quota_monitor.go:224] "QuotaMonitor created object count evaluator" resource="gateways.gateway.networking.k8s.io" I0915 22:17:25.816550 1 resource_quota_monitor.go:224] "QuotaMonitor created object count evaluator" resource="backends.gateway.envoyproxy.io" I0915 22:17:25.816577 1 resource_quota_monitor.go:224] "QuotaMonitor created object count evaluator" resource="referencegrants.gateway.networking.k8s.io" I0915 22:17:25.816602 1 resource_quota_monitor.go:224] "QuotaMonitor created object count evaluator" resource="backendtlspolicies.gateway.networking.k8s.io" I0915 22:17:25.816628 1 resource_quota_monitor.go:224] "QuotaMonitor created object count evaluator" resource="tlsroutes.gateway.networking.k8s.io" I0915 22:17:25.816649 1 resource_quota_monitor.go:224] "QuotaMonitor created object count evaluator" resource="udproutes.gateway.networking.k8s.io" I0915 22:17:25.816686 1 resource_quota_monitor.go:224] "QuotaMonitor created object count evaluator" resource="backendtrafficpolicies.gateway.envoyproxy.io" I0915 22:17:25.816705 1 resource_quota_monitor.go:224] "QuotaMonitor created object count evaluator" resource="xlistenersets.gateway.networking.x-k8s.io" I0915 22:17:25.816794 1 shared_informer.go:311] Waiting for caches to sync for resource quota I0915 22:17:26.142801 1 shared_informer.go:311] Waiting for caches to sync for garbage collector I0915 22:17:26.316948 1 shared_informer.go:318] Caches are synced for resource quota I0915 22:17:26.443848 1 shared_informer.go:318] Caches are synced for garbage collector I0915 22:17:34.488304 1 replica_set.go:676] "Finished syncing" kind="ReplicaSet" key="kube-system/cilium-operator-869df985b8" duration="152.695µs" I0915 22:17:34.558243 1 replica_set.go:676] "Finished syncing" kind="ReplicaSet" key="kube-system/cilium-operator-869df985b8" duration="11.798212ms" I0915 22:17:34.558630 1 replica_set.go:676] "Finished syncing" kind="ReplicaSet" key="kube-system/cilium-operator-869df985b8" duration="196.756µs" I0915 22:17:35.584440 1 job_controller.go:562] "enqueueing job" key="envoy-gateway-system/envoy-gateway-gateway-helm-certgen" I0915 22:17:35.604756 1 job_controller.go:562] "enqueueing job" key="envoy-gateway-system/envoy-gateway-gateway-helm-certgen" I0915 22:17:35.605743 1 event.go:307] "Event occurred" object="envoy-gateway-system/envoy-gateway-gateway-helm-certgen" fieldPath="" kind="Job" apiVersion="batch/v1" type="Normal" reason="SuccessfulCreate" message="Created pod: envoy-gateway-gateway-helm-certgen-hwnxt" I0915 22:17:35.619325 1 job_controller.go:562] "enqueueing job" key="envoy-gateway-system/envoy-gateway-gateway-helm-certgen" I0915 22:17:35.625377 1 job_controller.go:562] "enqueueing job" key="envoy-gateway-system/envoy-gateway-gateway-helm-certgen" I0915 22:17:40.702227 1 node_lifecycle_controller.go:1048] "Controller detected that some Nodes are Ready. Exiting master disruption mode" I0915 22:17:43.715794 1 replica_set.go:676] "Finished syncing" kind="ReplicaSet" key="kube-system/coredns-7c96b6546b" duration="68.772µs" I0915 22:17:43.718011 1 job_controller.go:562] "enqueueing job" key="envoy-gateway-system/envoy-gateway-gateway-helm-certgen" I0915 22:17:43.737293 1 replica_set.go:676] "Finished syncing" kind="ReplicaSet" key="kube-system/coredns-7c96b6546b" duration="128.834µs" I0915 22:17:43.748238 1 job_controller.go:562] "enqueueing job" key="envoy-gateway-system/envoy-gateway-gateway-helm-certgen" I0915 22:17:44.537893 1 replica_set.go:676] "Finished syncing" kind="ReplicaSet" key="kube-system/coredns-7c96b6546b" duration="219.766µs" I0915 22:17:45.554908 1 replica_set.go:676] "Finished syncing" kind="ReplicaSet" key="kube-system/coredns-7c96b6546b" duration="11.18583ms" I0915 22:17:45.555168 1 replica_set.go:676] "Finished syncing" kind="ReplicaSet" key="kube-system/coredns-7c96b6546b" duration="72.872µs" I0915 22:17:48.552563 1 job_controller.go:562] "enqueueing job" key="envoy-gateway-system/envoy-gateway-gateway-helm-certgen" I0915 22:17:49.564519 1 job_controller.go:562] "enqueueing job" key="envoy-gateway-system/envoy-gateway-gateway-helm-certgen" I0915 22:17:49.566759 1 job_controller.go:562] "enqueueing job" key="envoy-gateway-system/envoy-gateway-gateway-helm-certgen" I0915 22:17:50.577680 1 job_controller.go:562] "enqueueing job" key="envoy-gateway-system/envoy-gateway-gateway-helm-certgen" I0915 22:17:51.321393 1 job_controller.go:562] "enqueueing job" key="envoy-gateway-system/envoy-gateway-gateway-helm-certgen" I0915 22:17:51.588604 1 job_controller.go:562] "enqueueing job" key="envoy-gateway-system/envoy-gateway-gateway-helm-certgen" I0915 22:17:51.600401 1 job_controller.go:562] "enqueueing job" key="envoy-gateway-system/envoy-gateway-gateway-helm-certgen" I0915 22:17:51.610728 1 job_controller.go:562] "enqueueing job" key="envoy-gateway-system/envoy-gateway-gateway-helm-certgen" I0915 22:17:51.611274 1 event.go:307] "Event occurred" object="envoy-gateway-system/envoy-gateway-gateway-helm-certgen" fieldPath="" kind="Job" apiVersion="batch/v1" type="Normal" reason="Completed" message="Job completed" I0915 22:17:51.685242 1 event.go:307] "Event occurred" object="envoy-gateway-system/envoy-gateway" fieldPath="" kind="Deployment" apiVersion="apps/v1" type="Normal" reason="ScalingReplicaSet" message="Scaled up replica set envoy-gateway-78446f96c9 to 1" I0915 22:17:51.700114 1 event.go:307] "Event occurred" object="envoy-gateway-system/envoy-gateway-78446f96c9" fieldPath="" kind="ReplicaSet" apiVersion="apps/v1" type="Normal" reason="SuccessfulCreate" message="Created pod: envoy-gateway-78446f96c9-v7jg9" I0915 22:17:51.716395 1 replica_set.go:676] "Finished syncing" kind="ReplicaSet" key="envoy-gateway-system/envoy-gateway-78446f96c9" duration="31.536094ms" I0915 22:17:51.727051 1 replica_set.go:676] "Finished syncing" kind="ReplicaSet" key="envoy-gateway-system/envoy-gateway-78446f96c9" duration="10.610907ms" I0915 22:17:51.727193 1 replica_set.go:676] "Finished syncing" kind="ReplicaSet" key="envoy-gateway-system/envoy-gateway-78446f96c9" duration="81.922µs" I0915 22:17:51.732312 1 replica_set.go:676] "Finished syncing" kind="ReplicaSet" key="envoy-gateway-system/envoy-gateway-78446f96c9" duration="159.424µs" I0915 22:17:52.575807 1 replica_set.go:676] "Finished syncing" kind="ReplicaSet" key="envoy-gateway-system/envoy-gateway-78446f96c9" duration="89.703µs" I0915 22:17:54.934620 1 replica_set.go:676] "Finished syncing" kind="ReplicaSet" key="kube-system/coredns-67659f764b" duration="106.094µs" I0915 22:17:54.938387 1 replica_set.go:676] "Finished syncing" kind="ReplicaSet" key="kube-system/coredns-67659f764b" duration="75.472µs" I0915 22:17:54.967384 1 replica_set.go:676] "Finished syncing" kind="ReplicaSet" key="kube-system/coredns-67659f764b" duration="51.502µs" I0915 22:17:54.980810 1 replica_set.go:676] "Finished syncing" kind="ReplicaSet" key="kube-system/coredns-67659f764b" duration="73.912µs" I0915 22:17:56.326476 1 resource_quota_monitor.go:224] "QuotaMonitor created object count evaluator" resource="httproutefilters.gateway.envoyproxy.io" I0915 22:17:56.326536 1 resource_quota_monitor.go:224] "QuotaMonitor created object count evaluator" resource="securitypolicies.gateway.envoyproxy.io" I0915 22:17:56.326570 1 resource_quota_monitor.go:224] "QuotaMonitor created object count evaluator" resource="ciliumnodeconfigs.cilium.io" I0915 22:17:56.326617 1 resource_quota_monitor.go:224] "QuotaMonitor created object count evaluator" resource="envoypatchpolicies.gateway.envoyproxy.io" I0915 22:17:56.326651 1 resource_quota_monitor.go:224] "QuotaMonitor created object count evaluator" resource="ciliumnetworkpolicies.cilium.io" I0915 22:17:56.326691 1 resource_quota_monitor.go:224] "QuotaMonitor created object count evaluator" resource="envoyextensionpolicies.gateway.envoyproxy.io" I0915 22:17:56.326733 1 resource_quota_monitor.go:224] "QuotaMonitor created object count evaluator" resource="envoyproxies.gateway.envoyproxy.io" I0915 22:17:56.326805 1 resource_quota_monitor.go:224] "QuotaMonitor created object count evaluator" resource="clienttrafficpolicies.gateway.envoyproxy.io" I0915 22:17:56.326844 1 resource_quota_monitor.go:224] "QuotaMonitor created object count evaluator" resource="httproutes.gateway.networking.k8s.io" I0915 22:17:56.326884 1 resource_quota_monitor.go:224] "QuotaMonitor created object count evaluator" resource="ciliumendpoints.cilium.io" I0915 22:17:56.327620 1 shared_informer.go:311] Waiting for caches to sync for resource quota I0915 22:17:56.427787 1 shared_informer.go:318] Caches are synced for resource quota I0915 22:17:56.465628 1 shared_informer.go:311] Waiting for caches to sync for garbage collector I0915 22:17:56.566449 1 shared_informer.go:318] Caches are synced for garbage collector I0915 22:17:56.598943 1 replica_set.go:676] "Finished syncing" kind="ReplicaSet" key="kube-system/coredns-67659f764b" duration="201.465µs" I0915 22:17:56.632601 1 replica_set.go:676] "Finished syncing" kind="ReplicaSet" key="kube-system/coredns-67659f764b" duration="14.036606ms" I0915 22:17:56.632852 1 replica_set.go:676] "Finished syncing" kind="ReplicaSet" key="kube-system/coredns-67659f764b" duration="96.722µs" I0915 22:17:56.645606 1 event.go:307] "Event occurred" object="kube-system/coredns" fieldPath="" kind="Deployment" apiVersion="apps/v1" type="Normal" reason="ScalingReplicaSet" message="Scaled down replica set coredns-7c96b6546b to 0 from 1" I0915 22:17:56.652947 1 replica_set.go:676] "Finished syncing" kind="ReplicaSet" key="kube-system/coredns-67659f764b" duration="13.06016ms" I0915 22:17:56.653042 1 replica_set.go:676] "Finished syncing" kind="ReplicaSet" key="kube-system/coredns-67659f764b" duration="61.882µs" I0915 22:17:56.658349 1 event.go:307] "Event occurred" object="kube-system/coredns-7c96b6546b" fieldPath="" kind="ReplicaSet" apiVersion="apps/v1" type="Normal" reason="SuccessfulDelete" message="Deleted pod: coredns-7c96b6546b-zjllm" I0915 22:17:56.670960 1 replica_set.go:676] "Finished syncing" kind="ReplicaSet" key="kube-system/coredns-7c96b6546b" duration="26.219672ms" I0915 22:17:56.691087 1 replica_set.go:676] "Finished syncing" kind="ReplicaSet" key="kube-system/coredns-7c96b6546b" duration="20.069492ms" I0915 22:17:56.691273 1 replica_set.go:676] "Finished syncing" kind="ReplicaSet" key="kube-system/coredns-7c96b6546b" duration="122.414µs" I0915 22:17:59.408879 1 event.go:307] "Event occurred" object="local-path-storage/local-path-provisioner" fieldPath="" kind="Deployment" apiVersion="apps/v1" type="Normal" reason="ScalingReplicaSet" message="Scaled up replica set local-path-provisioner-679c578f5 to 1" I0915 22:17:59.423057 1 event.go:307] "Event occurred" object="local-path-storage/local-path-provisioner-679c578f5" fieldPath="" kind="ReplicaSet" apiVersion="apps/v1" type="Normal" reason="SuccessfulCreate" message="Created pod: local-path-provisioner-679c578f5-dl5hz" I0915 22:17:59.429649 1 replica_set.go:676] "Finished syncing" kind="ReplicaSet" key="local-path-storage/local-path-provisioner-679c578f5" duration="21.29079ms" I0915 22:17:59.443268 1 replica_set.go:676] "Finished syncing" kind="ReplicaSet" key="local-path-storage/local-path-provisioner-679c578f5" duration="13.478228ms" I0915 22:17:59.469957 1 replica_set.go:676] "Finished syncing" kind="ReplicaSet" key="local-path-storage/local-path-provisioner-679c578f5" duration="26.609476ms" I0915 22:17:59.470137 1 replica_set.go:676] "Finished syncing" kind="ReplicaSet" key="local-path-storage/local-path-provisioner-679c578f5" duration="117.093µs" I0915 22:18:01.975487 1 replica_set.go:676] "Finished syncing" kind="ReplicaSet" key="kube-system/coredns-7c96b6546b" duration="147.144µs" I0915 22:18:02.048909 1 replica_set.go:676] "Finished syncing" kind="ReplicaSet" key="envoy-gateway-system/envoy-gateway-78446f96c9" duration="16.168167ms" I0915 22:18:02.049002 1 replica_set.go:676] "Finished syncing" kind="ReplicaSet" key="envoy-gateway-system/envoy-gateway-78446f96c9" duration="60.541µs" I0915 22:18:02.633336 1 replica_set.go:676] "Finished syncing" kind="ReplicaSet" key="local-path-storage/local-path-provisioner-679c578f5" duration="11.84421ms" I0915 22:18:02.633407 1 replica_set.go:676] "Finished syncing" kind="ReplicaSet" key="local-path-storage/local-path-provisioner-679c578f5" duration="39.661µs" I0915 22:18:02.638082 1 replica_set.go:676] "Finished syncing" kind="ReplicaSet" key="kube-system/coredns-7c96b6546b" duration="53.032µs" I0915 22:18:02.648230 1 replica_set.go:676] "Finished syncing" kind="ReplicaSet" key="kube-system/coredns-7c96b6546b" duration="89.842µs" I0915 22:18:21.039513 1 job_controller.go:562] "enqueueing job" key="envoy-gateway-system/envoy-gateway-gateway-helm-certgen" I0915 22:18:21.092961 1 job_controller.go:562] "enqueueing job" key="envoy-gateway-system/envoy-gateway-gateway-helm-certgen" I0915 22:19:33.061089 1 event.go:307] "Event occurred" object="default/test-pvc" fieldPath="" kind="PersistentVolumeClaim" apiVersion="v1" type="Normal" reason="WaitForFirstConsumer" message="waiting for first consumer to be created before binding" I0915 22:19:33.726501 1 event.go:307] "Event occurred" object="default/test-pvc" fieldPath="" kind="PersistentVolumeClaim" apiVersion="v1" type="Normal" reason="ExternalProvisioning" message="Waiting for a volume to be created either by the external provisioner 'cluster.local/local-path-provisioner' or manually by the system administrator. If volume creation is delayed, please verify that the provisioner is running and correctly registered." I0915 22:19:33.726545 1 event.go:307] "Event occurred" object="default/test-pvc" fieldPath="" kind="PersistentVolumeClaim" apiVersion="v1" type="Normal" reason="ExternalProvisioning" message="Waiting for a volume to be created either by the external provisioner 'cluster.local/local-path-provisioner' or manually by the system administrator. If volume creation is delayed, please verify that the provisioner is running and correctly registered."