{"level":"warn","ts":"2026-10-04T09:43:33.42078Z","caller":"embed/config.go:679","msg":"Running http and grpc server on single port. This is not recommended for production."}
{"level":"info","ts":"2026-10-04T09:43:33.420856Z","caller":"etcdmain/etcd.go:73","msg":"Running: ","args":["etcd","--advertise-client-urls=https://162.253.55.209:2379","--cert-file=/etc/kubernetes/pki/etcd/server.crt","--client-cert-auth=true","--data-dir=/var/lib/etcd","--experimental-initial-corrupt-check=true","--experimental-watch-progress-notify-interval=5s","--initial-advertise-peer-urls=https://162.253.55.209:2380","--initial-cluster=instance=https://162.253.55.209:2380","--key-file=/etc/kubernetes/pki/etcd/server.key","--listen-client-urls=https://127.0.0.1:2379,https://162.253.55.209:2379","--listen-metrics-urls=http://127.0.0.1:2381","--listen-peer-urls=https://162.253.55.209:2380","--name=instance","--peer-cert-file=/etc/kubernetes/pki/etcd/peer.crt","--peer-client-cert-auth=true","--peer-key-file=/etc/kubernetes/pki/etcd/peer.key","--peer-trusted-ca-file=/etc/kubernetes/pki/etcd/ca.crt","--snapshot-count=10000","--tls-min-version=TLS1.3","--trusted-ca-file=/etc/kubernetes/pki/etcd/ca.crt"]}
{"level":"warn","ts":"2026-10-04T09:43:33.420906Z","caller":"embed/config.go:679","msg":"Running http and grpc server on single port. This is not recommended for production."}
{"level":"info","ts":"2026-10-04T09:43:33.420914Z","caller":"embed/etcd.go:127","msg":"configuring peer listeners","listen-peer-urls":["https://162.253.55.209:2380"]}
{"level":"info","ts":"2026-10-04T09:43:33.42093Z","caller":"embed/etcd.go:494","msg":"starting with peer TLS","tls-info":"cert = /etc/kubernetes/pki/etcd/peer.crt, key = /etc/kubernetes/pki/etcd/peer.key, client-cert=, client-key=, trusted-ca = /etc/kubernetes/pki/etcd/ca.crt, client-cert-auth = true, crl-file = ","cipher-suites":[]}
{"level":"info","ts":"2026-10-04T09:43:33.421517Z","caller":"embed/etcd.go:135","msg":"configuring client listeners","listen-client-urls":["https://127.0.0.1:2379","https://162.253.55.209:2379"]}
{"level":"info","ts":"2026-10-04T09:43:33.421594Z","caller":"embed/etcd.go:308","msg":"starting an etcd server","etcd-version":"3.5.12","git-sha":"e7b3bb6cc","go-version":"go1.20.13","go-os":"linux","go-arch":"amd64","max-cpu-set":8,"max-cpu-available":8,"member-initialized":false,"name":"instance","data-dir":"/var/lib/etcd","wal-dir":"","wal-dir-dedicated":"","member-dir":"/var/lib/etcd/member","force-new-cluster":false,"heartbeat-interval":"100ms","election-timeout":"1s","initial-election-tick-advance":true,"snapshot-count":10000,"max-wals":5,"max-snapshots":5,"snapshot-catchup-entries":5000,"initial-advertise-peer-urls":["https://162.253.55.209:2380"],"listen-peer-urls":["https://162.253.55.209:2380"],"advertise-client-urls":["https://162.253.55.209:2379"],"listen-client-urls":["https://127.0.0.1:2379","https://162.253.55.209:2379"],"listen-metrics-urls":["http://127.0.0.1:2381"],"cors":["*"],"host-whitelist":["*"],"initial-cluster":"instance=https://162.253.55.209:2380","initial-cluster-state":"new","initial-cluster-token":"etcd-cluster","quota-backend-bytes":2147483648,"max-request-bytes":1572864,"max-concurrent-streams":4294967295,"pre-vote":true,"initial-corrupt-check":true,"corrupt-check-time-interval":"0s","compact-check-time-enabled":false,"compact-check-time-interval":"1m0s","auto-compaction-mode":"periodic","auto-compaction-retention":"0s","auto-compaction-interval":"0s","discovery-url":"","discovery-proxy":"","downgrade-check-interval":"5s"}
{"level":"info","ts":"2026-10-04T09:43:33.426338Z","caller":"etcdserver/backend.go:81","msg":"opened backend db","path":"/var/lib/etcd/member/snap/db","took":"4.556034ms"}
{"level":"info","ts":"2026-10-04T09:43:33.433132Z","caller":"etcdserver/raft.go:495","msg":"starting local member","local-member-id":"53de2bdd9aa7b793","cluster-id":"385802231390d48c"}
{"level":"info","ts":"2026-10-04T09:43:33.433194Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"53de2bdd9aa7b793 switched to configuration voters=()"}
{"level":"info","ts":"2026-10-04T09:43:33.433214Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"53de2bdd9aa7b793 became follower at term 0"}
{"level":"info","ts":"2026-10-04T09:43:33.43323Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"newRaft 53de2bdd9aa7b793 [peers: [], term: 0, commit: 0, applied: 0, lastindex: 0, lastterm: 0]"}
{"level":"info","ts":"2026-10-04T09:43:33.433238Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"53de2bdd9aa7b793 became follower at term 1"}
{"level":"info","ts":"2026-10-04T09:43:33.433275Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"53de2bdd9aa7b793 switched to configuration voters=(6043315980760233875)"}
{"level":"warn","ts":"2026-10-04T09:43:33.444097Z","caller":"auth/store.go:1241","msg":"simple token is not cryptographically signed"}
{"level":"info","ts":"2026-10-04T09:43:33.448191Z","caller":"mvcc/kvstore.go:407","msg":"kvstore restored","current-rev":1}
{"level":"info","ts":"2026-10-04T09:43:33.449301Z","caller":"etcdserver/quota.go:94","msg":"enabled backend quota with default value","quota-name":"v3-applier","quota-size-bytes":2147483648,"quota-size":"2.1 GB"}
{"level":"info","ts":"2026-10-04T09:43:33.451662Z","caller":"etcdserver/server.go:860","msg":"starting etcd server","local-member-id":"53de2bdd9aa7b793","local-server-version":"3.5.12","cluster-version":"to_be_decided"}
{"level":"info","ts":"2026-10-04T09:43:33.452063Z","caller":"fileutil/purge.go:50","msg":"started to purge file","dir":"/var/lib/etcd/member/snap","suffix":"snap.db","max":5,"interval":"30s"}
{"level":"info","ts":"2026-10-04T09:43:33.452084Z","caller":"etcdserver/server.go:744","msg":"started as single-node; fast-forwarding election ticks","local-member-id":"53de2bdd9aa7b793","forward-ticks":9,"forward-duration":"900ms","election-ticks":10,"election-timeout":"1s"}
{"level":"info","ts":"2026-10-04T09:43:33.452159Z","caller":"fileutil/purge.go:50","msg":"started to purge file","dir":"/var/lib/etcd/member/snap","suffix":"snap","max":5,"interval":"30s"}
{"level":"info","ts":"2026-10-04T09:43:33.452168Z","caller":"fileutil/purge.go:50","msg":"started to purge file","dir":"/var/lib/etcd/member/wal","suffix":"wal","max":5,"interval":"30s"}
{"level":"info","ts":"2026-10-04T09:43:33.453067Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"53de2bdd9aa7b793 switched to configuration voters=(6043315980760233875)"}
{"level":"info","ts":"2026-10-04T09:43:33.453466Z","caller":"membership/cluster.go:421","msg":"added member","cluster-id":"385802231390d48c","local-member-id":"53de2bdd9aa7b793","added-peer-id":"53de2bdd9aa7b793","added-peer-peer-urls":["https://162.253.55.209:2380"]}
{"level":"info","ts":"2026-10-04T09:43:33.457439Z","caller":"embed/etcd.go:726","msg":"starting with client TLS","tls-info":"cert = /etc/kubernetes/pki/etcd/server.crt, key = /etc/kubernetes/pki/etcd/server.key, client-cert=, client-key=, trusted-ca = /etc/kubernetes/pki/etcd/ca.crt, client-cert-auth = true, crl-file = ","cipher-suites":[]}
{"level":"info","ts":"2026-10-04T09:43:33.457542Z","caller":"embed/etcd.go:597","msg":"serving peer traffic","address":"162.253.55.209:2380"}
{"level":"info","ts":"2026-10-04T09:43:33.45757Z","caller":"embed/etcd.go:569","msg":"cmux::serve","address":"162.253.55.209:2380"}
{"level":"info","ts":"2026-10-04T09:43:33.458915Z","caller":"embed/etcd.go:277","msg":"now serving peer/client/metrics","local-member-id":"53de2bdd9aa7b793","initial-advertise-peer-urls":["https://162.253.55.209:2380"],"listen-peer-urls":["https://162.253.55.209:2380"],"advertise-client-urls":["https://162.253.55.209:2379"],"listen-client-urls":["https://127.0.0.1:2379","https://162.253.55.209:2379"],"listen-metrics-urls":["http://127.0.0.1:2381"]}
{"level":"info","ts":"2026-10-04T09:43:33.459004Z","caller":"embed/etcd.go:857","msg":"serving metrics","address":"http://127.0.0.1:2381"}
{"level":"info","ts":"2026-10-04T09:43:34.134472Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"53de2bdd9aa7b793 is starting a new election at term 1"}
{"level":"info","ts":"2026-10-04T09:43:34.134543Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"53de2bdd9aa7b793 became pre-candidate at term 1"}
{"level":"info","ts":"2026-10-04T09:43:34.134577Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"53de2bdd9aa7b793 received MsgPreVoteResp from 53de2bdd9aa7b793 at term 1"}
{"level":"info","ts":"2026-10-04T09:43:34.134595Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"53de2bdd9aa7b793 became candidate at term 2"}
{"level":"info","ts":"2026-10-04T09:43:34.134606Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"53de2bdd9aa7b793 received MsgVoteResp from 53de2bdd9aa7b793 at term 2"}
{"level":"info","ts":"2026-10-04T09:43:34.13464Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"53de2bdd9aa7b793 became leader at term 2"}
{"level":"info","ts":"2026-10-04T09:43:34.134658Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"raft.node: 53de2bdd9aa7b793 elected leader 53de2bdd9aa7b793 at term 2"}
{"level":"info","ts":"2026-10-04T09:43:34.137089Z","caller":"etcdserver/server.go:2578","msg":"setting up initial cluster version using v2 API","cluster-version":"3.5"}
{"level":"info","ts":"2026-10-04T09:43:34.138266Z","caller":"etcdserver/server.go:2068","msg":"published local member to cluster through raft","local-member-id":"53de2bdd9aa7b793","local-member-attributes":"{Name:instance ClientURLs:[https://162.253.55.209:2379]}","request-path":"/0/members/53de2bdd9aa7b793/attributes","cluster-id":"385802231390d48c","publish-timeout":"7s"}
{"level":"info","ts":"2026-10-04T09:43:34.138311Z","caller":"embed/serve.go:103","msg":"ready to serve client requests"}
{"level":"info","ts":"2026-10-04T09:43:34.138386Z","caller":"embed/serve.go:103","msg":"ready to serve client requests"}
{"level":"info","ts":"2026-10-04T09:43:34.138685Z","caller":"etcdmain/main.go:44","msg":"notifying init daemon"}
{"level":"info","ts":"2026-10-04T09:43:34.138766Z","caller":"etcdmain/main.go:50","msg":"successfully notified init daemon"}
{"level":"info","ts":"2026-10-04T09:43:34.139153Z","caller":"membership/cluster.go:584","msg":"set initial cluster version","cluster-id":"385802231390d48c","local-member-id":"53de2bdd9aa7b793","cluster-version":"3.5"}
{"level":"info","ts":"2026-10-04T09:43:34.139241Z","caller":"api/capability.go:75","msg":"enabled capabilities for version","cluster-version":"3.5"}
{"level":"info","ts":"2026-10-04T09:43:34.13927Z","caller":"etcdserver/server.go:2602","msg":"cluster version is updated","cluster-version":"3.5"}
{"level":"info","ts":"2026-10-04T09:43:34.141649Z","caller":"embed/serve.go:250","msg":"serving client traffic securely","traffic":"grpc+http","address":"162.253.55.209:2379"}
{"level":"info","ts":"2026-10-04T09:43:34.141901Z","caller":"embed/serve.go:250","msg":"serving client traffic securely","traffic":"grpc+http","address":"127.0.0.1:2379"}
{"level":"info","ts":"2026-10-04T09:43:52.745679Z","caller":"traceutil/trace.go:171","msg":"trace[317614845] transaction","detail":"{read_only:false; response_revision:377; number_of_response:1; }","duration":"108.108497ms","start":"2026-10-04T09:43:52.637555Z","end":"2026-10-04T09:43:52.745663Z","steps":["trace[317614845] 'process raft request'  (duration: 107.972113ms)"],"step_count":1}
{"level":"info","ts":"2026-10-04T09:44:15.517027Z","caller":"traceutil/trace.go:171","msg":"trace[1953619342] transaction","detail":"{read_only:false; response_revision:581; number_of_response:1; }","duration":"646.443344ms","start":"2026-10-04T09:44:14.870551Z","end":"2026-10-04T09:44:15.516995Z","steps":["trace[1953619342] 'process raft request'  (duration: 646.316201ms)"],"step_count":1}
{"level":"warn","ts":"2026-10-04T09:44:15.5176Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-10-04T09:44:14.870533Z","time spent":"646.568137ms","remote":"127.0.0.1:44306","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":491,"response count":0,"response size":38,"request content":"compare:<target:MOD key:\"/registry/leases/kube-system/kube-controller-manager\" mod_revision:566 > success:<request_put:<key:\"/registry/leases/kube-system/kube-controller-manager\" value_size:431 >> failure:<request_range:<key:\"/registry/leases/kube-system/kube-controller-manager\" > >"}
{"level":"info","ts":"2026-10-04T09:44:15.60054Z","caller":"traceutil/trace.go:171","msg":"trace[1116835973] linearizableReadLoop","detail":"{readStateIndex:606; appliedIndex:605; }","duration":"289.460952ms","start":"2026-10-04T09:44:15.311021Z","end":"2026-10-04T09:44:15.600482Z","steps":["trace[1116835973] 'read index received'  (duration: 206.024035ms)","trace[1116835973] 'applied index is now lower than readState.Index'  (duration: 83.435877ms)"],"step_count":2}
{"level":"info","ts":"2026-10-04T09:44:15.60061Z","caller":"traceutil/trace.go:171","msg":"trace[1319991279] transaction","detail":"{read_only:false; response_revision:582; number_of_response:1; }","duration":"344.098683ms","start":"2026-10-04T09:44:15.256445Z","end":"2026-10-04T09:44:15.600544Z","steps":["trace[1319991279] 'process raft request'  (duration: 338.149965ms)"],"step_count":1}
{"level":"warn","ts":"2026-10-04T09:44:15.600917Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-10-04T09:44:15.256394Z","time spent":"344.426399ms","remote":"127.0.0.1:44168","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":1036265,"response count":0,"response size":38,"request content":"compare:<target:MOD key:\"/registry/secrets/envoy-gateway-system/sh.helm.release.v1.envoy-gateway.v1\" mod_revision:579 > success:<request_put:<key:\"/registry/secrets/envoy-gateway-system/sh.helm.release.v1.envoy-gateway.v1\" value_size:1036181 >> failure:<request_range:<key:\"/registry/secrets/envoy-gateway-system/sh.helm.release.v1.envoy-gateway.v1\" > >"}
{"level":"warn","ts":"2026-10-04T09:44:15.60119Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"290.149407ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/pods/kube-system/cilium-dgsmp\" ","response":"range_response_count:1 size:16965"}
{"level":"info","ts":"2026-10-04T09:44:15.601267Z","caller":"traceutil/trace.go:171","msg":"trace[577424819] range","detail":"{range_begin:/registry/pods/kube-system/cilium-dgsmp; range_end:; response_count:1; response_revision:582; }","duration":"290.28105ms","start":"2026-10-04T09:44:15.310971Z","end":"2026-10-04T09:44:15.601252Z","steps":["trace[577424819] 'agreement among raft nodes before linearized reading'  (duration: 289.81783ms)"],"step_count":1}
{"level":"info","ts":"2026-10-04T09:44:15.761419Z","caller":"traceutil/trace.go:171","msg":"trace[377534946] transaction","detail":"{read_only:false; response_revision:583; number_of_response:1; }","duration":"135.154156ms","start":"2026-10-04T09:44:15.625436Z","end":"2026-10-04T09:44:15.76059Z","steps":["trace[377534946] 'process raft request'  (duration: 124.892676ms)"],"step_count":1}
{"level":"warn","ts":"2026-10-04T09:44:30.543834Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"129.794759ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/pods/envoy-gateway-system/envoy-gateway-gateway-helm-certgen-fft9l\" ","response":"range_response_count:1 size:3965"}
{"level":"info","ts":"2026-10-04T09:44:30.543935Z","caller":"traceutil/trace.go:171","msg":"trace[1584389570] range","detail":"{range_begin:/registry/pods/envoy-gateway-system/envoy-gateway-gateway-helm-certgen-fft9l; range_end:; response_count:1; response_revision:747; }","duration":"129.931202ms","start":"2026-10-04T09:44:30.41398Z","end":"2026-10-04T09:44:30.543912Z","steps":["trace[1584389570] 'range keys from in-memory index tree'  (duration: 129.650877ms)"],"step_count":1}
{"level":"warn","ts":"2026-10-04T09:44:30.544723Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"167.356547ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/kube-scheduler\" ","response":"range_response_count:1 size:479"}
{"level":"info","ts":"2026-10-04T09:44:30.544778Z","caller":"traceutil/trace.go:171","msg":"trace[401854245] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:747; }","duration":"167.445989ms","start":"2026-10-04T09:44:30.377317Z","end":"2026-10-04T09:44:30.544763Z","steps":["trace[401854245] 'range keys from in-memory index tree'  (duration: 166.520371ms)"],"step_count":1}
{"level":"warn","ts":"2026-10-04T09:45:48.480764Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"232.922843ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"}
{"level":"warn","ts":"2026-10-04T09:45:48.480796Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"244.067307ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/openstack/rabbitmq-cluster-operator-leader-election\" ","response":"range_response_count:1 size:554"}
{"level":"info","ts":"2026-10-04T09:45:48.48087Z","caller":"traceutil/trace.go:171","msg":"trace[544101992] range","detail":"{range_begin:/registry/leases/openstack/rabbitmq-cluster-operator-leader-election; range_end:; response_count:1; response_revision:1816; }","duration":"244.119878ms","start":"2026-10-04T09:45:48.236713Z","end":"2026-10-04T09:45:48.480833Z","steps":["trace[544101992] 'range keys from in-memory index tree'  (duration: 243.941856ms)"],"step_count":1}
{"level":"info","ts":"2026-10-04T09:45:48.480867Z","caller":"traceutil/trace.go:171","msg":"trace[104079377] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:1816; }","duration":"233.008535ms","start":"2026-10-04T09:45:48.247808Z","end":"2026-10-04T09:45:48.480817Z","steps":["trace[104079377] 'range keys from in-memory index tree'  (duration: 232.807182ms)"],"step_count":1}
{"level":"warn","ts":"2026-10-04T09:45:48.480655Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"250.504601ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-svcs-lock\" ","response":"range_response_count:1 size:437"}
{"level":"info","ts":"2026-10-04T09:45:48.481276Z","caller":"traceutil/trace.go:171","msg":"trace[925114251] range","detail":"{range_begin:/registry/leases/kube-system/plndr-svcs-lock; range_end:; response_count:1; response_revision:1816; }","duration":"251.176059ms","start":"2026-10-04T09:45:48.23008Z","end":"2026-10-04T09:45:48.481256Z","steps":["trace[925114251] 'range keys from in-memory index tree'  (duration: 250.280677ms)"],"step_count":1}
{"level":"info","ts":"2026-10-04T09:45:48.617128Z","caller":"traceutil/trace.go:171","msg":"trace[1118400178] transaction","detail":"{read_only:false; response_revision:1818; number_of_response:1; }","duration":"131.210358ms","start":"2026-10-04T09:45:48.48589Z","end":"2026-10-04T09:45:48.6171Z","steps":["trace[1118400178] 'process raft request'  (duration: 97.199548ms)","trace[1118400178] 'compare'  (duration: 33.894958ms)"],"step_count":2}
{"level":"info","ts":"2026-10-04T09:45:48.942797Z","caller":"traceutil/trace.go:171","msg":"trace[1972339402] transaction","detail":"{read_only:false; response_revision:1820; number_of_response:1; }","duration":"144.323527ms","start":"2026-10-04T09:45:48.79844Z","end":"2026-10-04T09:45:48.942763Z","steps":["trace[1972339402] 'process raft request'  (duration: 144.143845ms)"],"step_count":1}
{"level":"info","ts":"2026-10-04T09:45:48.942732Z","caller":"traceutil/trace.go:171","msg":"trace[214940533] linearizableReadLoop","detail":"{readStateIndex:1896; appliedIndex:1895; }","duration":"137.166015ms","start":"2026-10-04T09:45:48.805547Z","end":"2026-10-04T09:45:48.942713Z","steps":["trace[214940533] 'read index received'  (duration: 137.056053ms)","trace[214940533] 'applied index is now lower than readState.Index'  (duration: 109.052µs)"],"step_count":2}
{"level":"warn","ts":"2026-10-04T09:45:48.943122Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"137.55545ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/pxc.percona.com/perconaxtradbclusters/openstack/percona-xtradb\" ","response":"range_response_count:1 size:5444"}
{"level":"info","ts":"2026-10-04T09:45:48.943167Z","caller":"traceutil/trace.go:171","msg":"trace[927091819] range","detail":"{range_begin:/registry/pxc.percona.com/perconaxtradbclusters/openstack/percona-xtradb; range_end:; response_count:1; response_revision:1820; }","duration":"137.62534ms","start":"2026-10-04T09:45:48.805524Z","end":"2026-10-04T09:45:48.943149Z","steps":["trace[927091819] 'agreement among raft nodes before linearized reading'  (duration: 137.493889ms)"],"step_count":1}
{"level":"info","ts":"2026-10-04T09:45:48.944884Z","caller":"traceutil/trace.go:171","msg":"trace[529899279] transaction","detail":"{read_only:false; response_revision:1821; number_of_response:1; }","duration":"132.92101ms","start":"2026-10-04T09:45:48.811951Z","end":"2026-10-04T09:45:48.944872Z","steps":["trace[529899279] 'process raft request'  (duration: 132.620176ms)"],"step_count":1}
{"level":"info","ts":"2026-10-04T09:46:00.391189Z","caller":"traceutil/trace.go:171","msg":"trace[1103365967] linearizableReadLoop","detail":"{readStateIndex:1996; appliedIndex:1995; }","duration":"199.031488ms","start":"2026-10-04T09:46:00.192127Z","end":"2026-10-04T09:46:00.391159Z","steps":["trace[1103365967] 'read index received'  (duration: 198.796515ms)","trace[1103365967] 'applied index is now lower than readState.Index'  (duration: 233.863µs)"],"step_count":2}
{"level":"warn","ts":"2026-10-04T09:46:00.391464Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"199.311811ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/cilium-operator-resource-lock\" ","response":"range_response_count:1 size:491"}
{"level":"warn","ts":"2026-10-04T09:46:00.391514Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"142.970118ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"}
{"level":"info","ts":"2026-10-04T09:46:00.391553Z","caller":"traceutil/trace.go:171","msg":"trace[622536386] range","detail":"{range_begin:/registry/leases/kube-system/cilium-operator-resource-lock; range_end:; response_count:1; response_revision:1918; }","duration":"199.463033ms","start":"2026-10-04T09:46:00.192074Z","end":"2026-10-04T09:46:00.391537Z","steps":["trace[622536386] 'agreement among raft nodes before linearized reading'  (duration: 199.23594ms)"],"step_count":1}
{"level":"info","ts":"2026-10-04T09:46:00.391594Z","caller":"traceutil/trace.go:171","msg":"trace[1032243534] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:1918; }","duration":"143.107959ms","start":"2026-10-04T09:46:00.248447Z","end":"2026-10-04T09:46:00.391555Z","steps":["trace[1032243534] 'agreement among raft nodes before linearized reading'  (duration: 142.962697ms)"],"step_count":1}
{"level":"info","ts":"2026-10-04T09:46:00.391297Z","caller":"traceutil/trace.go:171","msg":"trace[1224584342] transaction","detail":"{read_only:false; response_revision:1918; number_of_response:1; }","duration":"217.139004ms","start":"2026-10-04T09:46:00.174122Z","end":"2026-10-04T09:46:00.391261Z","steps":["trace[1224584342] 'process raft request'  (duration: 216.881961ms)"],"step_count":1}
{"level":"info","ts":"2026-10-04T09:46:00.846242Z","caller":"traceutil/trace.go:171","msg":"trace[971565861] transaction","detail":"{read_only:false; response_revision:1921; number_of_response:1; }","duration":"147.95964ms","start":"2026-10-04T09:46:00.698229Z","end":"2026-10-04T09:46:00.846189Z","steps":["trace[971565861] 'process raft request'  (duration: 134.664363ms)","trace[971565861] 'compare'  (duration: 12.75724ms)"],"step_count":2}
{"level":"warn","ts":"2026-10-04T09:46:37.598713Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"124.813223ms","expected-duration":"100ms","prefix":"","request":"header:<ID:13228093578936011408 username:\"kube-apiserver-etcd-client\" auth_revision:1 > txn:<compare:<target:MOD key:\"/registry/masterleases/162.253.55.209\" mod_revision:2080 > success:<request_put:<key:\"/registry/masterleases/162.253.55.209\" value_size:67 lease:4004721542081235597 >> failure:<request_range:<key:\"/registry/masterleases/162.253.55.209\" > >>","response":"size:16"}
{"level":"info","ts":"2026-10-04T09:46:37.598955Z","caller":"traceutil/trace.go:171","msg":"trace[1965080525] transaction","detail":"{read_only:false; response_revision:2132; number_of_response:1; }","duration":"231.450257ms","start":"2026-10-04T09:46:37.367486Z","end":"2026-10-04T09:46:37.598937Z","steps":["trace[1965080525] 'process raft request'  (duration: 231.376606ms)"],"step_count":1}
{"level":"info","ts":"2026-10-04T09:46:37.599046Z","caller":"traceutil/trace.go:171","msg":"trace[485534092] transaction","detail":"{read_only:false; response_revision:2131; number_of_response:1; }","duration":"234.409971ms","start":"2026-10-04T09:46:37.364593Z","end":"2026-10-04T09:46:37.599003Z","steps":["trace[485534092] 'process raft request'  (duration: 109.084052ms)","trace[485534092] 'compare'  (duration: 124.710662ms)"],"step_count":2}
{"level":"info","ts":"2026-10-04T09:46:37.876302Z","caller":"traceutil/trace.go:171","msg":"trace[1963950731] linearizableReadLoop","detail":"{readStateIndex:2219; appliedIndex:2218; }","duration":"275.264473ms","start":"2026-10-04T09:46:37.601009Z","end":"2026-10-04T09:46:37.876274Z","steps":["trace[1963950731] 'read index received'  (duration: 206.365716ms)","trace[1963950731] 'applied index is now lower than readState.Index'  (duration: 68.897607ms)"],"step_count":2}
{"level":"info","ts":"2026-10-04T09:46:37.876328Z","caller":"traceutil/trace.go:171","msg":"trace[2078485198] transaction","detail":"{read_only:false; response_revision:2133; number_of_response:1; }","duration":"398.506469ms","start":"2026-10-04T09:46:37.477793Z","end":"2026-10-04T09:46:37.876299Z","steps":["trace[2078485198] 'process raft request'  (duration: 329.594252ms)","trace[2078485198] 'compare'  (duration: 68.721485ms)"],"step_count":2}
{"level":"warn","ts":"2026-10-04T09:46:37.876439Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"275.407655ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/services/endpoints/default/kubernetes\" ","response":"range_response_count:1 size:422"}
{"level":"info","ts":"2026-10-04T09:46:37.876475Z","caller":"traceutil/trace.go:171","msg":"trace[673613327] range","detail":"{range_begin:/registry/services/endpoints/default/kubernetes; range_end:; response_count:1; response_revision:2133; }","duration":"275.497266ms","start":"2026-10-04T09:46:37.600967Z","end":"2026-10-04T09:46:37.876464Z","steps":["trace[673613327] 'agreement among raft nodes before linearized reading'  (duration: 275.403055ms)"],"step_count":1}
{"level":"warn","ts":"2026-10-04T09:46:37.876542Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-10-04T09:46:37.477773Z","time spent":"398.61929ms","remote":"127.0.0.1:44306","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":510,"response count":0,"response size":38,"request content":"compare:<target:MOD key:\"/registry/leases/openstack/08db1feb.percona.com\" mod_revision:2121 > success:<request_put:<key:\"/registry/leases/openstack/08db1feb.percona.com\" value_size:455 >> failure:<request_range:<key:\"/registry/leases/openstack/08db1feb.percona.com\" > >"}
{"level":"info","ts":"2026-10-04T09:47:18.916558Z","caller":"traceutil/trace.go:171","msg":"trace[1646991406] linearizableReadLoop","detail":"{readStateIndex:2552; appliedIndex:2551; }","duration":"139.62169ms","start":"2026-10-04T09:47:18.776912Z","end":"2026-10-04T09:47:18.916533Z","steps":["trace[1646991406] 'read index received'  (duration: 139.446112ms)","trace[1646991406] 'applied index is now lower than readState.Index'  (duration: 171.817µs)"],"step_count":2}
{"level":"info","ts":"2026-10-04T09:47:18.916673Z","caller":"traceutil/trace.go:171","msg":"trace[508884500] transaction","detail":"{read_only:false; response_revision:2456; number_of_response:1; }","duration":"146.964061ms","start":"2026-10-04T09:47:18.769699Z","end":"2026-10-04T09:47:18.916663Z","steps":["trace[508884500] 'process raft request'  (duration: 146.7049ms)"],"step_count":1}
{"level":"warn","ts":"2026-10-04T09:47:18.916861Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"139.938973ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/cilium-operator-resource-lock\" ","response":"range_response_count:1 size:492"}
{"level":"info","ts":"2026-10-04T09:47:18.916894Z","caller":"traceutil/trace.go:171","msg":"trace[1054301754] range","detail":"{range_begin:/registry/leases/kube-system/cilium-operator-resource-lock; range_end:; response_count:1; response_revision:2456; }","duration":"140.006186ms","start":"2026-10-04T09:47:18.77688Z","end":"2026-10-04T09:47:18.916886Z","steps":["trace[1054301754] 'agreement among raft nodes before linearized reading'  (duration: 139.748516ms)"],"step_count":1}
{"level":"info","ts":"2026-10-04T09:52:41.171012Z","caller":"traceutil/trace.go:171","msg":"trace[1781186353] linearizableReadLoop","detail":"{readStateIndex:4893; appliedIndex:4892; }","duration":"115.109828ms","start":"2026-10-04T09:52:41.055862Z","end":"2026-10-04T09:52:41.170972Z","steps":["trace[1781186353] 'read index received'  (duration: 25.661041ms)","trace[1781186353] 'applied index is now lower than readState.Index'  (duration: 89.446787ms)"],"step_count":2}
{"level":"info","ts":"2026-10-04T09:52:41.171411Z","caller":"traceutil/trace.go:171","msg":"trace[1273395900] transaction","detail":"{read_only:false; response_revision:4708; number_of_response:1; }","duration":"118.735897ms","start":"2026-10-04T09:52:41.052614Z","end":"2026-10-04T09:52:41.17135Z","steps":["trace[1273395900] 'process raft request'  (duration: 29.013976ms)","trace[1273395900] 'compare'  (duration: 88.842647ms)"],"step_count":2}
{"level":"warn","ts":"2026-10-04T09:52:41.171605Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"115.566095ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/cert-manager.io/certificates/monitoring/kube-prometheus-stack-prometheus-node-exporter-vh6mk-tls\" ","response":"range_response_count:1 size:2130"}
{"level":"info","ts":"2026-10-04T09:52:41.171685Z","caller":"traceutil/trace.go:171","msg":"trace[147397045] range","detail":"{range_begin:/registry/cert-manager.io/certificates/monitoring/kube-prometheus-stack-prometheus-node-exporter-vh6mk-tls; range_end:; response_count:1; response_revision:4708; }","duration":"115.85889ms","start":"2026-10-04T09:52:41.05581Z","end":"2026-10-04T09:52:41.171669Z","steps":["trace[147397045] 'agreement among raft nodes before linearized reading'  (duration: 115.387993ms)"],"step_count":1}
{"level":"info","ts":"2026-10-04T09:52:41.43945Z","caller":"traceutil/trace.go:171","msg":"trace[1756098363] transaction","detail":"{read_only:false; response_revision:4711; number_of_response:1; }","duration":"124.859908ms","start":"2026-10-04T09:52:41.314552Z","end":"2026-10-04T09:52:41.439412Z","steps":["trace[1756098363] 'process raft request'  (duration: 124.665295ms)"],"step_count":1}
{"level":"info","ts":"2026-10-04T09:52:41.440165Z","caller":"traceutil/trace.go:171","msg":"trace[1101032264] linearizableReadLoop","detail":"{readStateIndex:4896; appliedIndex:4896; }","duration":"114.64262ms","start":"2026-10-04T09:52:41.325509Z","end":"2026-10-04T09:52:41.440151Z","steps":["trace[1101032264] 'read index received'  (duration: 114.63432ms)","trace[1101032264] 'applied index is now lower than readState.Index'  (duration: 7.34µs)"],"step_count":2}
{"level":"warn","ts":"2026-10-04T09:52:41.440476Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"114.942615ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/kube-scheduler\" ","response":"range_response_count:1 size:480"}
{"level":"info","ts":"2026-10-04T09:52:41.440519Z","caller":"traceutil/trace.go:171","msg":"trace[1973930799] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:4711; }","duration":"115.055367ms","start":"2026-10-04T09:52:41.325453Z","end":"2026-10-04T09:52:41.440509Z","steps":["trace[1973930799] 'agreement among raft nodes before linearized reading'  (duration: 114.812053ms)"],"step_count":1}
{"level":"info","ts":"2026-10-04T09:52:41.448192Z","caller":"traceutil/trace.go:171","msg":"trace[1824233018] transaction","detail":"{read_only:false; response_revision:4712; number_of_response:1; }","duration":"121.491562ms","start":"2026-10-04T09:52:41.326642Z","end":"2026-10-04T09:52:41.448134Z","steps":["trace[1824233018] 'process raft request'  (duration: 121.331929ms)"],"step_count":1}
{"level":"warn","ts":"2026-10-04T09:52:43.573697Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"116.09106ms","expected-duration":"100ms","prefix":"","request":"header:<ID:13228093578936018327 username:\"kube-apiserver-etcd-client\" auth_revision:1 > txn:<compare:<target:MOD key:\"/registry/leases/openstack/08db1feb.percona.com\" mod_revision:4711 > success:<request_put:<key:\"/registry/leases/openstack/08db1feb.percona.com\" value_size:455 >> failure:<request_range:<key:\"/registry/leases/openstack/08db1feb.percona.com\" > >>","response":"size:16"}
{"level":"info","ts":"2026-10-04T09:52:43.573845Z","caller":"traceutil/trace.go:171","msg":"trace[1956609044] linearizableReadLoop","detail":"{readStateIndex:5001; appliedIndex:5000; }","duration":"112.839926ms","start":"2026-10-04T09:52:43.460984Z","end":"2026-10-04T09:52:43.573824Z","steps":["trace[1956609044] 'read index received'  (duration: 34.82µs)","trace[1956609044] 'applied index is now lower than readState.Index'  (duration: 112.803866ms)"],"step_count":2}
{"level":"info","ts":"2026-10-04T09:52:43.574001Z","caller":"traceutil/trace.go:171","msg":"trace[1984089459] transaction","detail":"{read_only:false; response_revision:4813; number_of_response:1; }","duration":"128.520234ms","start":"2026-10-04T09:52:43.44545Z","end":"2026-10-04T09:52:43.57397Z","steps":["trace[1984089459] 'process raft request'  (duration: 12.021627ms)","trace[1984089459] 'compare'  (duration: 115.892797ms)"],"step_count":2}
{"level":"warn","ts":"2026-10-04T09:52:43.574064Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"113.07329ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/kube-scheduler\" ","response":"range_response_count:1 size:480"}
{"level":"info","ts":"2026-10-04T09:52:43.574111Z","caller":"traceutil/trace.go:171","msg":"trace[1756736851] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:4813; }","duration":"113.132032ms","start":"2026-10-04T09:52:43.460965Z","end":"2026-10-04T09:52:43.574097Z","steps":["trace[1756736851] 'agreement among raft nodes before linearized reading'  (duration: 112.921838ms)"],"step_count":1}
{"level":"info","ts":"2026-10-04T09:52:43.575235Z","caller":"traceutil/trace.go:171","msg":"trace[700021460] transaction","detail":"{read_only:false; response_revision:4814; number_of_response:1; }","duration":"106.014614ms","start":"2026-10-04T09:52:43.469212Z","end":"2026-10-04T09:52:43.575226Z","steps":["trace[700021460] 'process raft request'  (duration: 105.963463ms)"],"step_count":1}
{"level":"warn","ts":"2026-10-04T09:52:46.148641Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"116.317048ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/namespaces/\" range_end:\"/registry/namespaces0\" count_only:true ","response":"range_response_count:0 size:7"}
{"level":"info","ts":"2026-10-04T09:52:46.148759Z","caller":"traceutil/trace.go:171","msg":"trace[81421528] range","detail":"{range_begin:/registry/namespaces/; range_end:/registry/namespaces0; response_count:0; response_revision:4847; }","duration":"116.46488ms","start":"2026-10-04T09:52:46.032261Z","end":"2026-10-04T09:52:46.148725Z","steps":["trace[81421528] 'count revisions from in-memory index tree'  (duration: 116.240917ms)"],"step_count":1}
{"level":"info","ts":"2026-10-04T09:52:50.112813Z","caller":"traceutil/trace.go:171","msg":"trace[100572771] transaction","detail":"{read_only:false; response_revision:4955; number_of_response:1; }","duration":"122.869957ms","start":"2026-10-04T09:52:49.989919Z","end":"2026-10-04T09:52:50.112789Z","steps":["trace[100572771] 'process raft request'  (duration: 122.693014ms)"],"step_count":1}
{"level":"info","ts":"2026-10-04T09:53:34.174217Z","caller":"mvcc/index.go:214","msg":"compact tree index","revision":2861}
{"level":"info","ts":"2026-10-04T09:53:34.250422Z","caller":"mvcc/kvstore_compaction.go:68","msg":"finished scheduled compaction","compact-revision":2861,"took":"74.672867ms","hash":3824858729,"current-db-size-bytes":51585024,"current-db-size":"52 MB","current-db-size-in-use-bytes":27959296,"current-db-size-in-use":"28 MB"}
{"level":"info","ts":"2026-10-04T09:53:34.250492Z","caller":"mvcc/hash.go:137","msg":"storing new hash","hash":3824858729,"revision":2861,"compact-revision":-1}
{"level":"info","ts":"2026-10-04T09:53:49.793939Z","caller":"traceutil/trace.go:171","msg":"trace[498702424] linearizableReadLoop","detail":"{readStateIndex:5726; appliedIndex:5724; }","duration":"185.482161ms","start":"2026-10-04T09:53:49.608431Z","end":"2026-10-04T09:53:49.793913Z","steps":["trace[498702424] 'read index received'  (duration: 4.116094ms)","trace[498702424] 'applied index is now lower than readState.Index'  (duration: 181.364787ms)"],"step_count":2}
{"level":"warn","ts":"2026-10-04T09:53:49.79418Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"185.729685ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/deployments/openstack/percona-xtradb-pitr\" ","response":"range_response_count:0 size:5"}
{"level":"info","ts":"2026-10-04T09:53:49.794277Z","caller":"traceutil/trace.go:171","msg":"trace[1548163336] range","detail":"{range_begin:/registry/deployments/openstack/percona-xtradb-pitr; range_end:; response_count:0; response_revision:5518; }","duration":"185.905027ms","start":"2026-10-04T09:53:49.608357Z","end":"2026-10-04T09:53:49.794262Z","steps":["trace[1548163336] 'agreement among raft nodes before linearized reading'  (duration: 185.698624ms)"],"step_count":1}
{"level":"info","ts":"2026-10-04T09:53:49.794099Z","caller":"traceutil/trace.go:171","msg":"trace[1823634358] transaction","detail":"{read_only:false; response_revision:5518; number_of_response:1; }","duration":"210.68583ms","start":"2026-10-04T09:53:49.583373Z","end":"2026-10-04T09:53:49.794059Z","steps":["trace[1823634358] 'process raft request'  (duration: 128.359626ms)","trace[1823634358] 'compare'  (duration: 82.05553ms)"],"step_count":2}
{"level":"warn","ts":"2026-10-04T09:53:49.794518Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"112.494831ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/openstack/messaging-topology-operator-leader-election\" ","response":"range_response_count:1 size:572"}
{"level":"info","ts":"2026-10-04T09:53:49.79458Z","caller":"traceutil/trace.go:171","msg":"trace[1188632098] range","detail":"{range_begin:/registry/leases/openstack/messaging-topology-operator-leader-election; range_end:; response_count:1; response_revision:5518; }","duration":"112.656073ms","start":"2026-10-04T09:53:49.681906Z","end":"2026-10-04T09:53:49.794563Z","steps":["trace[1188632098] 'agreement among raft nodes before linearized reading'  (duration: 112.162795ms)"],"step_count":1}
{"level":"info","ts":"2026-10-04T09:58:34.181163Z","caller":"mvcc/index.go:214","msg":"compact tree index","revision":5341}
{"level":"info","ts":"2026-10-04T09:58:34.265846Z","caller":"mvcc/kvstore_compaction.go:68","msg":"finished scheduled compaction","compact-revision":5341,"took":"82.69443ms","hash":3078678,"current-db-size-bytes":51585024,"current-db-size":"52 MB","current-db-size-in-use-bytes":18558976,"current-db-size-in-use":"19 MB"}
{"level":"info","ts":"2026-10-04T09:58:34.265927Z","caller":"mvcc/hash.go:137","msg":"storing new hash","hash":3078678,"revision":5341,"compact-revision":2861}
{"level":"info","ts":"2026-10-04T10:03:34.220188Z","caller":"mvcc/index.go:214","msg":"compact tree index","revision":7380}
{"level":"info","ts":"2026-10-04T10:03:34.315336Z","caller":"mvcc/kvstore_compaction.go:68","msg":"finished scheduled compaction","compact-revision":7380,"took":"91.553189ms","hash":3085635878,"current-db-size-bytes":51585024,"current-db-size":"52 MB","current-db-size-in-use-bytes":15228928,"current-db-size-in-use":"15 MB"}
{"level":"info","ts":"2026-10-04T10:03:34.315402Z","caller":"mvcc/hash.go:137","msg":"storing new hash","hash":3085635878,"revision":7380,"compact-revision":5341}