{"level":"warn","ts":"2026-07-23T23:44:51.415358Z","caller":"embed/config.go:679","msg":"Running http and grpc server on single port. This is not recommended for production."}
{"level":"info","ts":"2026-07-23T23:44:51.41553Z","caller":"etcdmain/etcd.go:73","msg":"Running: ","args":["etcd","--advertise-client-urls=https://199.204.45.235: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://199.204.45.235:2380","--initial-cluster=instance=https://199.204.45.235:2380","--key-file=/etc/kubernetes/pki/etcd/server.key","--listen-client-urls=https://127.0.0.1:2379,https://199.204.45.235:2379","--listen-metrics-urls=http://127.0.0.1:2381","--listen-peer-urls=https://199.204.45.235: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-07-23T23:44:51.415658Z","caller":"embed/config.go:679","msg":"Running http and grpc server on single port. This is not recommended for production."}
{"level":"info","ts":"2026-07-23T23:44:51.415675Z","caller":"embed/etcd.go:127","msg":"configuring peer listeners","listen-peer-urls":["https://199.204.45.235:2380"]}
{"level":"info","ts":"2026-07-23T23:44:51.417269Z","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-07-23T23:44:51.419662Z","caller":"embed/etcd.go:135","msg":"configuring client listeners","listen-client-urls":["https://127.0.0.1:2379","https://199.204.45.235:2379"]}
{"level":"info","ts":"2026-07-23T23:44:51.420044Z","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://199.204.45.235:2380"],"listen-peer-urls":["https://199.204.45.235:2380"],"advertise-client-urls":["https://199.204.45.235:2379"],"listen-client-urls":["https://127.0.0.1:2379","https://199.204.45.235:2379"],"listen-metrics-urls":["http://127.0.0.1:2381"],"cors":["*"],"host-whitelist":["*"],"initial-cluster":"instance=https://199.204.45.235: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-07-23T23:44:51.423648Z","caller":"etcdserver/backend.go:81","msg":"opened backend db","path":"/var/lib/etcd/member/snap/db","took":"2.798999ms"}
{"level":"info","ts":"2026-07-23T23:44:51.431209Z","caller":"etcdserver/raft.go:495","msg":"starting local member","local-member-id":"aab6040abcf11","cluster-id":"2bae7d3d8857c059"}
{"level":"info","ts":"2026-07-23T23:44:51.43132Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"aab6040abcf11 switched to configuration voters=()"}
{"level":"info","ts":"2026-07-23T23:44:51.431465Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"aab6040abcf11 became follower at term 0"}
{"level":"info","ts":"2026-07-23T23:44:51.431488Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"newRaft aab6040abcf11 [peers: [], term: 0, commit: 0, applied: 0, lastindex: 0, lastterm: 0]"}
{"level":"info","ts":"2026-07-23T23:44:51.431508Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"aab6040abcf11 became follower at term 1"}
{"level":"info","ts":"2026-07-23T23:44:51.431674Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"aab6040abcf11 switched to configuration voters=(3003179657318161)"}
{"level":"warn","ts":"2026-07-23T23:44:51.439388Z","caller":"auth/store.go:1241","msg":"simple token is not cryptographically signed"}
{"level":"info","ts":"2026-07-23T23:44:51.442781Z","caller":"mvcc/kvstore.go:407","msg":"kvstore restored","current-rev":1}
{"level":"info","ts":"2026-07-23T23:44:51.449421Z","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-07-23T23:44:51.456982Z","caller":"etcdserver/server.go:860","msg":"starting etcd server","local-member-id":"aab6040abcf11","local-server-version":"3.5.12","cluster-version":"to_be_decided"}
{"level":"info","ts":"2026-07-23T23:44:51.46026Z","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-07-23T23:44:51.460612Z","caller":"embed/etcd.go:277","msg":"now serving peer/client/metrics","local-member-id":"aab6040abcf11","initial-advertise-peer-urls":["https://199.204.45.235:2380"],"listen-peer-urls":["https://199.204.45.235:2380"],"advertise-client-urls":["https://199.204.45.235:2379"],"listen-client-urls":["https://127.0.0.1:2379","https://199.204.45.235:2379"],"listen-metrics-urls":["http://127.0.0.1:2381"]}
{"level":"info","ts":"2026-07-23T23:44:51.460652Z","caller":"embed/etcd.go:857","msg":"serving metrics","address":"http://127.0.0.1:2381"}
{"level":"info","ts":"2026-07-23T23:44:51.461293Z","caller":"etcdserver/server.go:744","msg":"started as single-node; fast-forwarding election ticks","local-member-id":"aab6040abcf11","forward-ticks":9,"forward-duration":"900ms","election-ticks":10,"election-timeout":"1s"}
{"level":"info","ts":"2026-07-23T23:44:51.461546Z","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-07-23T23:44:51.461642Z","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-07-23T23:44:51.461719Z","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-07-23T23:44:51.461663Z","caller":"embed/etcd.go:597","msg":"serving peer traffic","address":"199.204.45.235:2380"}
{"level":"info","ts":"2026-07-23T23:44:51.461859Z","caller":"embed/etcd.go:569","msg":"cmux::serve","address":"199.204.45.235:2380"}
{"level":"info","ts":"2026-07-23T23:44:51.462254Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"aab6040abcf11 switched to configuration voters=(3003179657318161)"}
{"level":"info","ts":"2026-07-23T23:44:51.462446Z","caller":"membership/cluster.go:421","msg":"added member","cluster-id":"2bae7d3d8857c059","local-member-id":"aab6040abcf11","added-peer-id":"aab6040abcf11","added-peer-peer-urls":["https://199.204.45.235:2380"]}
{"level":"info","ts":"2026-07-23T23:44:52.432732Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"aab6040abcf11 is starting a new election at term 1"}
{"level":"info","ts":"2026-07-23T23:44:52.43283Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"aab6040abcf11 became pre-candidate at term 1"}
{"level":"info","ts":"2026-07-23T23:44:52.432868Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"aab6040abcf11 received MsgPreVoteResp from aab6040abcf11 at term 1"}
{"level":"info","ts":"2026-07-23T23:44:52.433016Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"aab6040abcf11 became candidate at term 2"}
{"level":"info","ts":"2026-07-23T23:44:52.433042Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"aab6040abcf11 received MsgVoteResp from aab6040abcf11 at term 2"}
{"level":"info","ts":"2026-07-23T23:44:52.433134Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"aab6040abcf11 became leader at term 2"}
{"level":"info","ts":"2026-07-23T23:44:52.433162Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"raft.node: aab6040abcf11 elected leader aab6040abcf11 at term 2"}
{"level":"info","ts":"2026-07-23T23:44:52.434225Z","caller":"etcdserver/server.go:2578","msg":"setting up initial cluster version using v2 API","cluster-version":"3.5"}
{"level":"info","ts":"2026-07-23T23:44:52.435265Z","caller":"etcdserver/server.go:2068","msg":"published local member to cluster through raft","local-member-id":"aab6040abcf11","local-member-attributes":"{Name:instance ClientURLs:[https://199.204.45.235:2379]}","request-path":"/0/members/aab6040abcf11/attributes","cluster-id":"2bae7d3d8857c059","publish-timeout":"7s"}
{"level":"info","ts":"2026-07-23T23:44:52.435307Z","caller":"embed/serve.go:103","msg":"ready to serve client requests"}
{"level":"info","ts":"2026-07-23T23:44:52.43568Z","caller":"etcdmain/main.go:44","msg":"notifying init daemon"}
{"level":"info","ts":"2026-07-23T23:44:52.435773Z","caller":"etcdmain/main.go:50","msg":"successfully notified init daemon"}
{"level":"info","ts":"2026-07-23T23:44:52.435892Z","caller":"embed/serve.go:103","msg":"ready to serve client requests"}
{"level":"info","ts":"2026-07-23T23:44:52.438195Z","caller":"membership/cluster.go:584","msg":"set initial cluster version","cluster-id":"2bae7d3d8857c059","local-member-id":"aab6040abcf11","cluster-version":"3.5"}
{"level":"info","ts":"2026-07-23T23:44:52.438466Z","caller":"api/capability.go:75","msg":"enabled capabilities for version","cluster-version":"3.5"}
{"level":"info","ts":"2026-07-23T23:44:52.438548Z","caller":"etcdserver/server.go:2602","msg":"cluster version is updated","cluster-version":"3.5"}
{"level":"info","ts":"2026-07-23T23:44:52.442709Z","caller":"embed/serve.go:250","msg":"serving client traffic securely","traffic":"grpc+http","address":"127.0.0.1:2379"}
{"level":"info","ts":"2026-07-23T23:44:52.443186Z","caller":"embed/serve.go:250","msg":"serving client traffic securely","traffic":"grpc+http","address":"199.204.45.235:2379"}
{"level":"info","ts":"2026-07-23T23:45:16.196816Z","caller":"traceutil/trace.go:171","msg":"trace[1173869245] linearizableReadLoop","detail":"{readStateIndex:411; appliedIndex:408; }","duration":"122.687476ms","start":"2026-07-23T23:45:16.074088Z","end":"2026-07-23T23:45:16.196776Z","steps":["trace[1173869245] 'read index received'  (duration: 19.065548ms)","trace[1173869245] 'applied index is now lower than readState.Index'  (duration: 103.618447ms)"],"step_count":2}
{"level":"info","ts":"2026-07-23T23:45:16.197005Z","caller":"traceutil/trace.go:171","msg":"trace[2124296977] transaction","detail":"{read_only:false; response_revision:395; number_of_response:1; }","duration":"128.969362ms","start":"2026-07-23T23:45:16.068023Z","end":"2026-07-23T23:45:16.196993Z","steps":["trace[2124296977] 'process raft request'  (duration: 128.627227ms)"],"step_count":1}
{"level":"info","ts":"2026-07-23T23:45:16.197082Z","caller":"traceutil/trace.go:171","msg":"trace[1080578733] transaction","detail":"{read_only:false; response_revision:394; number_of_response:1; }","duration":"130.342253ms","start":"2026-07-23T23:45:16.066698Z","end":"2026-07-23T23:45:16.197041Z","steps":["trace[1080578733] 'process raft request'  (duration: 111.093406ms)","trace[1080578733] 'compare'  (duration: 18.678372ms)"],"step_count":2}
{"level":"warn","ts":"2026-07-23T23:45:16.197569Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"123.464141ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/kube-scheduler\" ","response":"range_response_count:1 size:478"}
{"level":"info","ts":"2026-07-23T23:45:16.198564Z","caller":"traceutil/trace.go:171","msg":"trace[1102088631] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:399; }","duration":"124.495156ms","start":"2026-07-23T23:45:16.074043Z","end":"2026-07-23T23:45:16.198538Z","steps":["trace[1102088631] 'agreement among raft nodes before linearized reading'  (duration: 123.261791ms)"],"step_count":1}
{"level":"info","ts":"2026-07-23T23:45:45.772801Z","caller":"traceutil/trace.go:171","msg":"trace[1226874675] linearizableReadLoop","detail":"{readStateIndex:650; appliedIndex:649; }","duration":"106.145351ms","start":"2026-07-23T23:45:45.666629Z","end":"2026-07-23T23:45:45.772774Z","steps":["trace[1226874675] 'read index received'  (duration: 105.995006ms)","trace[1226874675] 'applied index is now lower than readState.Index'  (duration: 149.085µs)"],"step_count":2}
{"level":"warn","ts":"2026-07-23T23:45:45.773652Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"107.007452ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/pods/kube-system/cilium-x85fc\" ","response":"range_response_count:1 size:16965"}
{"level":"info","ts":"2026-07-23T23:45:45.773703Z","caller":"traceutil/trace.go:171","msg":"trace[970722871] range","detail":"{range_begin:/registry/pods/kube-system/cilium-x85fc; range_end:; response_count:1; response_revision:623; }","duration":"107.128486ms","start":"2026-07-23T23:45:45.666561Z","end":"2026-07-23T23:45:45.77369Z","steps":["trace[970722871] 'agreement among raft nodes before linearized reading'  (duration: 106.321428ms)"],"step_count":1}
{"level":"warn","ts":"2026-07-23T23:45:46.00315Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"211.512057ms","expected-duration":"100ms","prefix":"","request":"header:<ID:14920882487153060995 username:\"kube-apiserver-etcd-client\" auth_revision:1 > txn:<compare:<target:MOD key:\"/registry/masterleases/199.204.45.235\" mod_revision:591 > success:<request_put:<key:\"/registry/masterleases/199.204.45.235\" value_size:67 lease:5697510450298285184 >> failure:<request_range:<key:\"/registry/masterleases/199.204.45.235\" > >>","response":"size:16"}
{"level":"info","ts":"2026-07-23T23:45:46.003282Z","caller":"traceutil/trace.go:171","msg":"trace[1706220861] transaction","detail":"{read_only:false; response_revision:624; number_of_response:1; }","duration":"228.249626ms","start":"2026-07-23T23:45:45.775012Z","end":"2026-07-23T23:45:46.003261Z","steps":["trace[1706220861] 'process raft request'  (duration: 16.090007ms)","trace[1706220861] 'compare'  (duration: 211.362462ms)"],"step_count":2}
{"level":"info","ts":"2026-07-23T23:45:46.003799Z","caller":"traceutil/trace.go:171","msg":"trace[262689889] linearizableReadLoop","detail":"{readStateIndex:652; appliedIndex:651; }","duration":"125.310384ms","start":"2026-07-23T23:45:45.878467Z","end":"2026-07-23T23:45:46.003777Z","steps":["trace[262689889] 'read index received'  (duration: 125.228591ms)","trace[262689889] 'applied index is now lower than readState.Index'  (duration: 81.073µs)"],"step_count":2}
{"level":"warn","ts":"2026-07-23T23:45:46.003949Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"125.46493ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"}
{"level":"info","ts":"2026-07-23T23:45:46.003978Z","caller":"traceutil/trace.go:171","msg":"trace[1836698028] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:625; }","duration":"125.555233ms","start":"2026-07-23T23:45:45.878414Z","end":"2026-07-23T23:45:46.003969Z","steps":["trace[1836698028] 'agreement among raft nodes before linearized reading'  (duration: 125.450679ms)"],"step_count":1}
{"level":"info","ts":"2026-07-23T23:45:46.004009Z","caller":"traceutil/trace.go:171","msg":"trace[1074216276] transaction","detail":"{read_only:false; response_revision:625; number_of_response:1; }","duration":"214.830311ms","start":"2026-07-23T23:45:45.78915Z","end":"2026-07-23T23:45:46.003981Z","steps":["trace[1074216276] 'process raft request'  (duration: 214.51592ms)"],"step_count":1}
{"level":"info","ts":"2026-07-23T23:47:18.706017Z","caller":"traceutil/trace.go:171","msg":"trace[1435945451] transaction","detail":"{read_only:false; response_revision:1850; number_of_response:1; }","duration":"217.999366ms","start":"2026-07-23T23:47:18.487986Z","end":"2026-07-23T23:47:18.705985Z","steps":["trace[1435945451] 'process raft request'  (duration: 217.795212ms)"],"step_count":1}
{"level":"warn","ts":"2026-07-23T23:47:18.706221Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"142.172609ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/kube-controller-manager\" ","response":"range_response_count:1 size:506"}
{"level":"info","ts":"2026-07-23T23:47:18.706277Z","caller":"traceutil/trace.go:171","msg":"trace[485534777] range","detail":"{range_begin:/registry/leases/kube-system/kube-controller-manager; range_end:; response_count:1; response_revision:1850; }","duration":"142.277891ms","start":"2026-07-23T23:47:18.563985Z","end":"2026-07-23T23:47:18.706263Z","steps":["trace[485534777] 'agreement among raft nodes before linearized reading'  (duration: 142.092747ms)"],"step_count":1}
{"level":"info","ts":"2026-07-23T23:47:18.705955Z","caller":"traceutil/trace.go:171","msg":"trace[1381257570] linearizableReadLoop","detail":"{readStateIndex:1927; appliedIndex:1926; }","duration":"141.899043ms","start":"2026-07-23T23:47:18.564027Z","end":"2026-07-23T23:47:18.705926Z","steps":["trace[1381257570] 'read index received'  (duration: 141.652978ms)","trace[1381257570] 'applied index is now lower than readState.Index'  (duration: 244.875µs)"],"step_count":2}
{"level":"info","ts":"2026-07-23T23:47:19.164256Z","caller":"traceutil/trace.go:171","msg":"trace[262279576] transaction","detail":"{read_only:false; response_revision:1853; number_of_response:1; }","duration":"205.003567ms","start":"2026-07-23T23:47:18.959229Z","end":"2026-07-23T23:47:19.164232Z","steps":["trace[262279576] 'process raft request'  (duration: 204.804902ms)"],"step_count":1}
{"level":"info","ts":"2026-07-23T23:47:19.164421Z","caller":"traceutil/trace.go:171","msg":"trace[1837622865] transaction","detail":"{read_only:false; response_revision:1854; number_of_response:1; }","duration":"205.15148ms","start":"2026-07-23T23:47:18.959238Z","end":"2026-07-23T23:47:19.164389Z","steps":["trace[1837622865] 'process raft request'  (duration: 204.959255ms)"],"step_count":1}
{"level":"warn","ts":"2026-07-23T23:48:07.249751Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-07-23T23:48:06.893911Z","time spent":"355.836637ms","remote":"127.0.0.1:59712","response type":"/etcdserverpb.Lease/LeaseGrant","request count":-1,"request size":-1,"response count":-1,"response size":-1,"request content":""}
{"level":"warn","ts":"2026-07-23T23:48:07.654077Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"109.887822ms","expected-duration":"100ms","prefix":"","request":"header:<ID:14920882487153064123 username:\"kube-apiserver-etcd-client\" auth_revision:1 > txn:<compare:<target:MOD key:\"/registry/leases/openstack/messaging-topology-operator-leader-election\" mod_revision:2149 > success:<request_put:<key:\"/registry/leases/openstack/messaging-topology-operator-leader-election\" value_size:478 >> failure:<request_range:<key:\"/registry/leases/openstack/messaging-topology-operator-leader-election\" > >>","response":"size:16"}
{"level":"info","ts":"2026-07-23T23:48:07.654247Z","caller":"traceutil/trace.go:171","msg":"trace[1209723356] linearizableReadLoop","detail":"{readStateIndex:2249; appliedIndex:2247; }","duration":"703.565157ms","start":"2026-07-23T23:48:06.95064Z","end":"2026-07-23T23:48:07.654205Z","steps":["trace[1209723356] 'read index received'  (duration: 298.969354ms)","trace[1209723356] 'applied index is now lower than readState.Index'  (duration: 404.593923ms)"],"step_count":2}
{"level":"info","ts":"2026-07-23T23:48:07.654422Z","caller":"traceutil/trace.go:171","msg":"trace[1760436653] transaction","detail":"{read_only:false; response_revision:2161; number_of_response:1; }","duration":"751.975872ms","start":"2026-07-23T23:48:06.902407Z","end":"2026-07-23T23:48:07.654383Z","steps":["trace[1760436653] 'process raft request'  (duration: 641.634962ms)","trace[1760436653] 'compare'  (duration: 109.612327ms)"],"step_count":2}
{"level":"warn","ts":"2026-07-23T23:48:07.654527Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"703.886703ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/kube-controller-manager\" ","response":"range_response_count:1 size:506"}
{"level":"info","ts":"2026-07-23T23:48:07.654578Z","caller":"traceutil/trace.go:171","msg":"trace[1029249193] range","detail":"{range_begin:/registry/leases/kube-system/kube-controller-manager; range_end:; response_count:1; response_revision:2161; }","duration":"703.996476ms","start":"2026-07-23T23:48:06.950564Z","end":"2026-07-23T23:48:07.654561Z","steps":["trace[1029249193] 'agreement among raft nodes before linearized reading'  (duration: 703.756021ms)"],"step_count":1}
{"level":"warn","ts":"2026-07-23T23:48:07.654622Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-07-23T23:48:06.950531Z","time spent":"704.081757ms","remote":"127.0.0.1:59870","response type":"/etcdserverpb.KV/Range","request count":0,"request size":54,"response count":1,"response size":527,"request content":"key:\"/registry/leases/kube-system/kube-controller-manager\" "}
{"level":"warn","ts":"2026-07-23T23:48:07.654743Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-07-23T23:48:06.902396Z","time spent":"752.106644ms","remote":"127.0.0.1:59870","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":556,"response count":0,"response size":37,"request content":"compare:<target:MOD key:\"/registry/leases/openstack/messaging-topology-operator-leader-election\" mod_revision:2149 > success:<request_put:<key:\"/registry/leases/openstack/messaging-topology-operator-leader-election\" value_size:478 >> failure:<request_range:<key:\"/registry/leases/openstack/messaging-topology-operator-leader-election\" > >"}
{"level":"warn","ts":"2026-07-23T23:48:07.67197Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"253.223268ms","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-07-23T23:48:07.671985Z","caller":"traceutil/trace.go:171","msg":"trace[1449813270] transaction","detail":"{read_only:false; response_revision:2162; number_of_response:1; }","duration":"421.02507ms","start":"2026-07-23T23:48:07.250922Z","end":"2026-07-23T23:48:07.671947Z","steps":["trace[1449813270] 'process raft request'  (duration: 420.645723ms)"],"step_count":1}
{"level":"info","ts":"2026-07-23T23:48:07.672042Z","caller":"traceutil/trace.go:171","msg":"trace[410428249] range","detail":"{range_begin:/registry/leases/kube-system/plndr-svcs-lock; range_end:; response_count:1; response_revision:2162; }","duration":"253.343579ms","start":"2026-07-23T23:48:07.41868Z","end":"2026-07-23T23:48:07.672024Z","steps":["trace[410428249] 'agreement among raft nodes before linearized reading'  (duration: 253.103265ms)"],"step_count":1}
{"level":"warn","ts":"2026-07-23T23:48:07.672037Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"251.7697ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/openstack/rabbitmq-cluster-operator-leader-election\" ","response":"range_response_count:1 size:555"}
{"level":"warn","ts":"2026-07-23T23:48:07.672138Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"253.873749ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-cp-lock\" ","response":"range_response_count:1 size:433"}
{"level":"warn","ts":"2026-07-23T23:48:07.67215Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-07-23T23:48:07.250899Z","time spent":"421.160453ms","remote":"127.0.0.1:59712","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":831,"response count":0,"response size":37,"request content":"compare:<target:MOD key:\"/registry/events/openstack/percona-xtradb-haproxy-0.18c5100b08690f39\" mod_revision:2136 > success:<request_put:<key:\"/registry/events/openstack/percona-xtradb-haproxy-0.18c5100b08690f39\" value_size:745 lease:5697510450298288313 >> failure:<request_range:<key:\"/registry/events/openstack/percona-xtradb-haproxy-0.18c5100b08690f39\" > >"}
{"level":"info","ts":"2026-07-23T23:48:07.672188Z","caller":"traceutil/trace.go:171","msg":"trace[1016355188] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:2162; }","duration":"254.015753ms","start":"2026-07-23T23:48:07.418156Z","end":"2026-07-23T23:48:07.672172Z","steps":["trace[1016355188] 'agreement among raft nodes before linearized reading'  (duration: 253.930461ms)"],"step_count":1}
{"level":"info","ts":"2026-07-23T23:48:07.67213Z","caller":"traceutil/trace.go:171","msg":"trace[1904827170] range","detail":"{range_begin:/registry/leases/openstack/rabbitmq-cluster-operator-leader-election; range_end:; response_count:1; response_revision:2162; }","duration":"251.932933ms","start":"2026-07-23T23:48:07.42018Z","end":"2026-07-23T23:48:07.672113Z","steps":["trace[1904827170] 'agreement among raft nodes before linearized reading'  (duration: 251.686709ms)"],"step_count":1}
{"level":"warn","ts":"2026-07-23T23:48:07.672061Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"360.832656ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/kube-scheduler\" ","response":"range_response_count:1 size:479"}
{"level":"warn","ts":"2026-07-23T23:48:07.672361Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"508.463542ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/pods/openstack/percona-xtradb-pxc-0\" ","response":"range_response_count:1 size:12386"}
{"level":"info","ts":"2026-07-23T23:48:07.672357Z","caller":"traceutil/trace.go:171","msg":"trace[590949265] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:2162; }","duration":"361.176763ms","start":"2026-07-23T23:48:07.31116Z","end":"2026-07-23T23:48:07.672337Z","steps":["trace[590949265] 'agreement among raft nodes before linearized reading'  (duration: 360.818397ms)"],"step_count":1}
{"level":"info","ts":"2026-07-23T23:48:07.672401Z","caller":"traceutil/trace.go:171","msg":"trace[1517374443] range","detail":"{range_begin:/registry/pods/openstack/percona-xtradb-pxc-0; range_end:; response_count:1; response_revision:2162; }","duration":"508.530774ms","start":"2026-07-23T23:48:07.163863Z","end":"2026-07-23T23:48:07.672393Z","steps":["trace[1517374443] 'agreement among raft nodes before linearized reading'  (duration: 508.3485ms)"],"step_count":1}
{"level":"warn","ts":"2026-07-23T23:48:07.672415Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-07-23T23:48:07.311129Z","time spent":"361.271385ms","remote":"127.0.0.1:59870","response type":"/etcdserverpb.KV/Range","request count":0,"request size":45,"response count":1,"response size":500,"request content":"key:\"/registry/leases/kube-system/kube-scheduler\" "}
{"level":"warn","ts":"2026-07-23T23:48:07.672469Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-07-23T23:48:07.163812Z","time spent":"508.635266ms","remote":"127.0.0.1:59804","response type":"/etcdserverpb.KV/Range","request count":0,"request size":47,"response count":1,"response size":12407,"request content":"key:\"/registry/pods/openstack/percona-xtradb-pxc-0\" "}
{"level":"info","ts":"2026-07-23T23:48:49.461961Z","caller":"traceutil/trace.go:171","msg":"trace[1871414068] transaction","detail":"{read_only:false; response_revision:2495; number_of_response:1; }","duration":"212.106081ms","start":"2026-07-23T23:48:49.249828Z","end":"2026-07-23T23:48:49.461934Z","steps":["trace[1871414068] 'process raft request'  (duration: 211.922048ms)"],"step_count":1}
{"level":"info","ts":"2026-07-23T23:49:22.073996Z","caller":"traceutil/trace.go:171","msg":"trace[1662956671] transaction","detail":"{read_only:false; response_revision:2674; number_of_response:1; }","duration":"103.169545ms","start":"2026-07-23T23:49:21.970789Z","end":"2026-07-23T23:49:22.073958Z","steps":["trace[1662956671] 'process raft request'  (duration: 102.834329ms)"],"step_count":1}
{"level":"warn","ts":"2026-07-23T23:49:22.302827Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"128.19319ms","expected-duration":"100ms","prefix":"","request":"header:<ID:14920882487153065386 username:\"kube-apiserver-etcd-client\" auth_revision:1 > txn:<compare:<target:MOD key:\"/registry/leases/kube-system/plndr-svcs-lock\" mod_revision:2667 > success:<request_put:<key:\"/registry/leases/kube-system/plndr-svcs-lock\" value_size:370 >> failure:<request_range:<key:\"/registry/leases/kube-system/plndr-svcs-lock\" > >>","response":"size:16"}
{"level":"info","ts":"2026-07-23T23:49:22.303025Z","caller":"traceutil/trace.go:171","msg":"trace[429544281] linearizableReadLoop","detail":"{readStateIndex:2784; appliedIndex:2783; }","duration":"138.056132ms","start":"2026-07-23T23:49:22.164887Z","end":"2026-07-23T23:49:22.302943Z","steps":["trace[429544281] 'read index received'  (duration: 9.558477ms)","trace[429544281] 'applied index is now lower than readState.Index'  (duration: 128.493815ms)"],"step_count":2}
{"level":"warn","ts":"2026-07-23T23:49:22.303253Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"138.319116ms","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-07-23T23:49:22.303348Z","caller":"traceutil/trace.go:171","msg":"trace[295974400] range","detail":"{range_begin:/registry/namespaces/; range_end:/registry/namespaces0; response_count:0; response_revision:2679; }","duration":"138.436148ms","start":"2026-07-23T23:49:22.164858Z","end":"2026-07-23T23:49:22.303294Z","steps":["trace[295974400] 'agreement among raft nodes before linearized reading'  (duration: 138.260466ms)"],"step_count":1}
{"level":"info","ts":"2026-07-23T23:49:22.304027Z","caller":"traceutil/trace.go:171","msg":"trace[612501781] transaction","detail":"{read_only:false; response_revision:2679; number_of_response:1; }","duration":"170.70368ms","start":"2026-07-23T23:49:22.133299Z","end":"2026-07-23T23:49:22.304003Z","steps":["trace[612501781] 'process raft request'  (duration: 41.240077ms)","trace[612501781] 'compare'  (duration: 127.947306ms)"],"step_count":2}
{"level":"warn","ts":"2026-07-23T23:49:22.584868Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"118.060264ms","expected-duration":"100ms","prefix":"","request":"header:<ID:14920882487153065389 username:\"kube-apiserver-etcd-client\" auth_revision:1 > txn:<compare:<target:MOD key:\"/registry/leases/kube-system/cilium-operator-resource-lock\" mod_revision:2670 > success:<request_put:<key:\"/registry/leases/kube-system/cilium-operator-resource-lock\" value_size:410 >> failure:<request_range:<key:\"/registry/leases/kube-system/cilium-operator-resource-lock\" > >>","response":"size:16"}
{"level":"info","ts":"2026-07-23T23:49:22.585475Z","caller":"traceutil/trace.go:171","msg":"trace[1071644162] transaction","detail":"{read_only:false; response_revision:2680; number_of_response:1; }","duration":"266.393183ms","start":"2026-07-23T23:49:22.319054Z","end":"2026-07-23T23:49:22.585447Z","steps":["trace[1071644162] 'process raft request'  (duration: 147.675738ms)","trace[1071644162] 'compare'  (duration: 117.953162ms)"],"step_count":2}
{"level":"info","ts":"2026-07-23T23:49:22.6162Z","caller":"traceutil/trace.go:171","msg":"trace[830517922] transaction","detail":"{read_only:false; response_revision:2681; number_of_response:1; }","duration":"195.612293ms","start":"2026-07-23T23:49:22.420566Z","end":"2026-07-23T23:49:22.616178Z","steps":["trace[830517922] 'process raft request'  (duration: 194.971692ms)"],"step_count":1}
{"level":"info","ts":"2026-07-23T23:52:57.022838Z","caller":"traceutil/trace.go:171","msg":"trace[1148434645] transaction","detail":"{read_only:false; response_revision:4519; number_of_response:1; }","duration":"126.559044ms","start":"2026-07-23T23:52:56.896255Z","end":"2026-07-23T23:52:57.022814Z","steps":["trace[1148434645] 'process raft request'  (duration: 123.885121ms)"],"step_count":1}
{"level":"info","ts":"2026-07-23T23:53:03.326123Z","caller":"traceutil/trace.go:171","msg":"trace[1660472718] linearizableReadLoop","detail":"{readStateIndex:4807; appliedIndex:4806; }","duration":"130.223654ms","start":"2026-07-23T23:53:03.195876Z","end":"2026-07-23T23:53:03.326099Z","steps":["trace[1660472718] 'read index received'  (duration: 129.995508ms)","trace[1660472718] 'applied index is now lower than readState.Index'  (duration: 227.246µs)"],"step_count":2}
{"level":"info","ts":"2026-07-23T23:53:03.326164Z","caller":"traceutil/trace.go:171","msg":"trace[2076397505] transaction","detail":"{read_only:false; response_revision:4629; number_of_response:1; }","duration":"272.551817ms","start":"2026-07-23T23:53:03.05359Z","end":"2026-07-23T23:53:03.326142Z","steps":["trace[2076397505] 'process raft request'  (duration: 272.332942ms)"],"step_count":1}
{"level":"warn","ts":"2026-07-23T23:53:03.326412Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"130.48558ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/kube-controller-manager\" ","response":"range_response_count:1 size:506"}
{"level":"warn","ts":"2026-07-23T23:53:03.326542Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"114.436047ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-cp-lock\" ","response":"range_response_count:1 size:433"}
{"level":"info","ts":"2026-07-23T23:53:03.326457Z","caller":"traceutil/trace.go:171","msg":"trace[1214219901] range","detail":"{range_begin:/registry/leases/kube-system/kube-controller-manager; range_end:; response_count:1; response_revision:4629; }","duration":"130.605382ms","start":"2026-07-23T23:53:03.195839Z","end":"2026-07-23T23:53:03.326445Z","steps":["trace[1214219901] 'agreement among raft nodes before linearized reading'  (duration: 130.384987ms)"],"step_count":1}
{"level":"info","ts":"2026-07-23T23:53:03.326629Z","caller":"traceutil/trace.go:171","msg":"trace[2144348533] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:4629; }","duration":"114.549702ms","start":"2026-07-23T23:53:03.212058Z","end":"2026-07-23T23:53:03.326607Z","steps":["trace[2144348533] 'agreement among raft nodes before linearized reading'  (duration: 114.338387ms)"],"step_count":1}
{"level":"warn","ts":"2026-07-23T23:53:03.326654Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"128.463813ms","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-07-23T23:53:03.326797Z","caller":"traceutil/trace.go:171","msg":"trace[1645994430] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:4629; }","duration":"128.682818ms","start":"2026-07-23T23:53:03.198098Z","end":"2026-07-23T23:53:03.326781Z","steps":["trace[1645994430] 'agreement among raft nodes before linearized reading'  (duration: 128.299059ms)"],"step_count":1}
{"level":"warn","ts":"2026-07-23T23:53:03.326871Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"130.413768ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/openstack/rabbitmq-cluster-operator-leader-election\" ","response":"range_response_count:1 size:555"}
{"level":"info","ts":"2026-07-23T23:53:03.326933Z","caller":"traceutil/trace.go:171","msg":"trace[706830827] range","detail":"{range_begin:/registry/leases/openstack/rabbitmq-cluster-operator-leader-election; range_end:; response_count:1; response_revision:4629; }","duration":"130.509311ms","start":"2026-07-23T23:53:03.196403Z","end":"2026-07-23T23:53:03.326913Z","steps":["trace[706830827] 'agreement among raft nodes before linearized reading'  (duration: 129.855486ms)"],"step_count":1}
{"level":"info","ts":"2026-07-23T23:53:03.958348Z","caller":"traceutil/trace.go:171","msg":"trace[1232953507] transaction","detail":"{read_only:false; response_revision:4642; number_of_response:1; }","duration":"176.880124ms","start":"2026-07-23T23:53:03.78143Z","end":"2026-07-23T23:53:03.95831Z","steps":["trace[1232953507] 'process raft request'  (duration: 176.631869ms)"],"step_count":1}
{"level":"info","ts":"2026-07-23T23:53:03.958189Z","caller":"traceutil/trace.go:171","msg":"trace[1625586489] linearizableReadLoop","detail":"{readStateIndex:4820; appliedIndex:4818; }","duration":"152.996ms","start":"2026-07-23T23:53:03.805175Z","end":"2026-07-23T23:53:03.958171Z","steps":["trace[1625586489] 'read index received'  (duration: 43.079846ms)","trace[1625586489] 'applied index is now lower than readState.Index'  (duration: 109.915484ms)"],"step_count":2}
{"level":"warn","ts":"2026-07-23T23:53:03.95891Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"142.870115ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/persistentvolumeclaims/monitoring/alertmanager-kube-prometheus-stack-alertmanager-db-alertmanager-kube-prometheus-stack-alertmanager-0\" ","response":"range_response_count:1 size:1935"}
{"level":"info","ts":"2026-07-23T23:53:03.95895Z","caller":"traceutil/trace.go:171","msg":"trace[665608407] range","detail":"{range_begin:/registry/persistentvolumeclaims/monitoring/alertmanager-kube-prometheus-stack-alertmanager-db-alertmanager-kube-prometheus-stack-alertmanager-0; range_end:; response_count:1; response_revision:4642; }","duration":"142.919917ms","start":"2026-07-23T23:53:03.816018Z","end":"2026-07-23T23:53:03.958938Z","steps":["trace[665608407] 'agreement among raft nodes before linearized reading'  (duration: 142.790813ms)"],"step_count":1}
{"level":"warn","ts":"2026-07-23T23:53:03.959534Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"154.343312ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/pods/local-path-storage/helper-pod-create-pvc-7c1b07f6-b8dc-4b88-b270-093c43e23ad4\" ","response":"range_response_count:1 size:3646"}
{"level":"info","ts":"2026-07-23T23:53:03.959658Z","caller":"traceutil/trace.go:171","msg":"trace[967602471] range","detail":"{range_begin:/registry/pods/local-path-storage/helper-pod-create-pvc-7c1b07f6-b8dc-4b88-b270-093c43e23ad4; range_end:; response_count:1; response_revision:4642; }","duration":"154.516546ms","start":"2026-07-23T23:53:03.80512Z","end":"2026-07-23T23:53:03.959637Z","steps":["trace[967602471] 'agreement among raft nodes before linearized reading'  (duration: 153.39409ms)"],"step_count":1}
{"level":"info","ts":"2026-07-23T23:53:15.475133Z","caller":"traceutil/trace.go:171","msg":"trace[646906081] transaction","detail":"{read_only:false; response_revision:4807; number_of_response:1; }","duration":"185.89611ms","start":"2026-07-23T23:53:15.289212Z","end":"2026-07-23T23:53:15.475108Z","steps":["trace[646906081] 'process raft request'  (duration: 185.710766ms)"],"step_count":1}
{"level":"info","ts":"2026-07-23T23:53:15.608255Z","caller":"traceutil/trace.go:171","msg":"trace[616820661] transaction","detail":"{read_only:false; response_revision:4808; number_of_response:1; }","duration":"182.81924ms","start":"2026-07-23T23:53:15.425412Z","end":"2026-07-23T23:53:15.608231Z","steps":["trace[616820661] 'process raft request'  (duration: 150.033202ms)","trace[616820661] 'compare'  (duration: 32.463291ms)"],"step_count":2}
{"level":"info","ts":"2026-07-23T23:53:15.608414Z","caller":"traceutil/trace.go:171","msg":"trace[1371889694] linearizableReadLoop","detail":"{readStateIndex:4990; appliedIndex:4989; }","duration":"133.32509ms","start":"2026-07-23T23:53:15.475076Z","end":"2026-07-23T23:53:15.608401Z","steps":["trace[1371889694] 'read index received'  (duration: 100.318038ms)","trace[1371889694] 'applied index is now lower than readState.Index'  (duration: 33.006192ms)"],"step_count":2}
{"level":"info","ts":"2026-07-23T23:53:15.608482Z","caller":"traceutil/trace.go:171","msg":"trace[1694877264] transaction","detail":"{read_only:false; response_revision:4809; number_of_response:1; }","duration":"128.397337ms","start":"2026-07-23T23:53:15.480077Z","end":"2026-07-23T23:53:15.608475Z","steps":["trace[1694877264] 'process raft request'  (duration: 127.939917ms)"],"step_count":1}
{"level":"warn","ts":"2026-07-23T23:53:15.608694Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"147.706979ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-cp-lock\" ","response":"range_response_count:1 size:434"}
{"level":"warn","ts":"2026-07-23T23:53:15.608715Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"173.610089ms","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-07-23T23:53:15.60875Z","caller":"traceutil/trace.go:171","msg":"trace[1821945059] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:4810; }","duration":"147.81669ms","start":"2026-07-23T23:53:15.460921Z","end":"2026-07-23T23:53:15.608737Z","steps":["trace[1821945059] 'agreement among raft nodes before linearized reading'  (duration: 147.623516ms)"],"step_count":1}
{"level":"info","ts":"2026-07-23T23:53:15.608758Z","caller":"traceutil/trace.go:171","msg":"trace[1937147808] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:4810; }","duration":"173.655999ms","start":"2026-07-23T23:53:15.435089Z","end":"2026-07-23T23:53:15.608745Z","steps":["trace[1937147808] 'agreement among raft nodes before linearized reading'  (duration: 173.546067ms)"],"step_count":1}
{"level":"warn","ts":"2026-07-23T23:53:15.608828Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"171.227445ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/kube-controller-manager\" ","response":"range_response_count:1 size:507"}
{"level":"warn","ts":"2026-07-23T23:53:15.608927Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"158.584406ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-svcs-lock\" ","response":"range_response_count:1 size:438"}
{"level":"info","ts":"2026-07-23T23:53:15.609612Z","caller":"traceutil/trace.go:171","msg":"trace[114016807] range","detail":"{range_begin:/registry/leases/kube-system/plndr-svcs-lock; range_end:; response_count:1; response_revision:4810; }","duration":"159.267142ms","start":"2026-07-23T23:53:15.450309Z","end":"2026-07-23T23:53:15.609576Z","steps":["trace[114016807] 'agreement among raft nodes before linearized reading'  (duration: 158.540166ms)"],"step_count":1}
{"level":"info","ts":"2026-07-23T23:53:15.608932Z","caller":"traceutil/trace.go:171","msg":"trace[121766399] range","detail":"{range_begin:/registry/leases/kube-system/kube-controller-manager; range_end:; response_count:1; response_revision:4810; }","duration":"171.449119ms","start":"2026-07-23T23:53:15.437462Z","end":"2026-07-23T23:53:15.608911Z","steps":["trace[121766399] 'agreement among raft nodes before linearized reading'  (duration: 171.02666ms)"],"step_count":1}
{"level":"info","ts":"2026-07-23T23:53:15.755987Z","caller":"traceutil/trace.go:171","msg":"trace[1796908059] transaction","detail":"{read_only:false; response_revision:4815; number_of_response:1; }","duration":"127.199741ms","start":"2026-07-23T23:53:15.628742Z","end":"2026-07-23T23:53:15.755942Z","steps":["trace[1796908059] 'process raft request'  (duration: 114.205196ms)","trace[1796908059] 'compare'  (duration: 12.803131ms)"],"step_count":2}
{"level":"info","ts":"2026-07-23T23:54:52.463071Z","caller":"mvcc/index.go:214","msg":"compact tree index","revision":2838}
{"level":"info","ts":"2026-07-23T23:54:52.56668Z","caller":"mvcc/kvstore_compaction.go:68","msg":"finished scheduled compaction","compact-revision":2838,"took":"102.088193ms","hash":2564846419,"current-db-size-bytes":54112256,"current-db-size":"54 MB","current-db-size-in-use-bytes":29356032,"current-db-size-in-use":"29 MB"}
{"level":"info","ts":"2026-07-23T23:54:52.566746Z","caller":"mvcc/hash.go:137","msg":"storing new hash","hash":2564846419,"revision":2838,"compact-revision":-1}
{"level":"info","ts":"2026-07-23T23:56:52.591065Z","caller":"traceutil/trace.go:171","msg":"trace[1238115485] linearizableReadLoop","detail":"{readStateIndex:6623; appliedIndex:6621; }","duration":"125.89692ms","start":"2026-07-23T23:56:52.465146Z","end":"2026-07-23T23:56:52.591043Z","steps":["trace[1238115485] 'read index received'  (duration: 71.42218ms)","trace[1238115485] 'applied index is now lower than readState.Index'  (duration: 54.47388ms)"],"step_count":2}
{"level":"info","ts":"2026-07-23T23:56:52.591198Z","caller":"traceutil/trace.go:171","msg":"trace[1846417194] transaction","detail":"{read_only:false; response_revision:6389; number_of_response:1; }","duration":"129.071724ms","start":"2026-07-23T23:56:52.462086Z","end":"2026-07-23T23:56:52.591158Z","steps":["trace[1846417194] 'process raft request'  (duration: 128.82585ms)"],"step_count":1}
{"level":"warn","ts":"2026-07-23T23:56:52.591269Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"126.110624ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/jobs/openstack/horizon-db-sync\" ","response":"range_response_count:1 size:4859"}
{"level":"info","ts":"2026-07-23T23:56:52.591307Z","caller":"traceutil/trace.go:171","msg":"trace[1944729716] range","detail":"{range_begin:/registry/jobs/openstack/horizon-db-sync; range_end:; response_count:1; response_revision:6389; }","duration":"126.190257ms","start":"2026-07-23T23:56:52.465105Z","end":"2026-07-23T23:56:52.591295Z","steps":["trace[1944729716] 'agreement among raft nodes before linearized reading'  (duration: 126.060024ms)"],"step_count":1}
{"level":"info","ts":"2026-07-23T23:57:14.174674Z","caller":"traceutil/trace.go:171","msg":"trace[983709219] transaction","detail":"{read_only:false; response_revision:6554; number_of_response:1; }","duration":"125.018651ms","start":"2026-07-23T23:57:14.049633Z","end":"2026-07-23T23:57:14.174651Z","steps":["trace[983709219] 'process raft request'  (duration: 124.876348ms)"],"step_count":1}
{"level":"info","ts":"2026-07-23T23:57:38.88214Z","caller":"traceutil/trace.go:171","msg":"trace[1953599708] transaction","detail":"{read_only:false; response_revision:6684; number_of_response:1; }","duration":"112.118733ms","start":"2026-07-23T23:57:38.77Z","end":"2026-07-23T23:57:38.882119Z","steps":["trace[1953599708] 'process raft request'  (duration: 111.976029ms)"],"step_count":1}
{"level":"info","ts":"2026-07-23T23:57:39.371139Z","caller":"traceutil/trace.go:171","msg":"trace[1437941107] transaction","detail":"{read_only:false; response_revision:6689; number_of_response:1; }","duration":"132.221042ms","start":"2026-07-23T23:57:39.238867Z","end":"2026-07-23T23:57:39.371088Z","steps":["trace[1437941107] 'process raft request'  (duration: 106.061094ms)","trace[1437941107] 'compare'  (duration: 25.871502ms)"],"step_count":2}
{"level":"info","ts":"2026-07-23T23:59:52.469072Z","caller":"mvcc/index.go:214","msg":"compact tree index","revision":5580}
{"level":"info","ts":"2026-07-23T23:59:52.565666Z","caller":"mvcc/kvstore_compaction.go:68","msg":"finished scheduled compaction","compact-revision":5580,"took":"94.980769ms","hash":1196577650,"current-db-size-bytes":54112256,"current-db-size":"54 MB","current-db-size-in-use-bytes":18219008,"current-db-size-in-use":"18 MB"}
{"level":"info","ts":"2026-07-23T23:59:52.565748Z","caller":"mvcc/hash.go:137","msg":"storing new hash","hash":1196577650,"revision":5580,"compact-revision":2838}