{"level":"warn","ts":"2026-05-19T00:01:23.733137Z","caller":"embed/config.go:679","msg":"Running http and grpc server on single port. This is not recommended for production."} {"level":"info","ts":"2026-05-19T00:01:23.73326Z","caller":"etcdmain/etcd.go:73","msg":"Running: ","args":["etcd","--advertise-client-urls=https://199.204.45.216: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.216:2380","--initial-cluster=instance=https://199.204.45.216:2380","--key-file=/etc/kubernetes/pki/etcd/server.key","--listen-client-urls=https://127.0.0.1:2379,https://199.204.45.216:2379","--listen-metrics-urls=http://127.0.0.1:2381","--listen-peer-urls=https://199.204.45.216: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-05-19T00:01:23.733362Z","caller":"embed/config.go:679","msg":"Running http and grpc server on single port. This is not recommended for production."} {"level":"info","ts":"2026-05-19T00:01:23.733384Z","caller":"embed/etcd.go:127","msg":"configuring peer listeners","listen-peer-urls":["https://199.204.45.216:2380"]} {"level":"info","ts":"2026-05-19T00:01:23.733416Z","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-05-19T00:01:23.735051Z","caller":"embed/etcd.go:135","msg":"configuring client listeners","listen-client-urls":["https://127.0.0.1:2379","https://199.204.45.216:2379"]} {"level":"info","ts":"2026-05-19T00:01:23.737421Z","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.216:2380"],"listen-peer-urls":["https://199.204.45.216:2380"],"advertise-client-urls":["https://199.204.45.216:2379"],"listen-client-urls":["https://127.0.0.1:2379","https://199.204.45.216:2379"],"listen-metrics-urls":["http://127.0.0.1:2381"],"cors":["*"],"host-whitelist":["*"],"initial-cluster":"instance=https://199.204.45.216: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-05-19T00:01:23.741825Z","caller":"etcdserver/backend.go:81","msg":"opened backend db","path":"/var/lib/etcd/member/snap/db","took":"4.072122ms"} {"level":"info","ts":"2026-05-19T00:01:23.752094Z","caller":"etcdserver/raft.go:495","msg":"starting local member","local-member-id":"4e98569549cc430c","cluster-id":"65d70b4d1d4a8bf9"} {"level":"info","ts":"2026-05-19T00:01:23.752175Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"4e98569549cc430c switched to configuration voters=()"} {"level":"info","ts":"2026-05-19T00:01:23.752207Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"4e98569549cc430c became follower at term 0"} {"level":"info","ts":"2026-05-19T00:01:23.752227Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"newRaft 4e98569549cc430c [peers: [], term: 0, commit: 0, applied: 0, lastindex: 0, lastterm: 0]"} {"level":"info","ts":"2026-05-19T00:01:23.752244Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"4e98569549cc430c became follower at term 1"} {"level":"info","ts":"2026-05-19T00:01:23.752307Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"4e98569549cc430c switched to configuration voters=(5663371730606637836)"} {"level":"warn","ts":"2026-05-19T00:01:23.758945Z","caller":"auth/store.go:1241","msg":"simple token is not cryptographically signed"} {"level":"info","ts":"2026-05-19T00:01:23.760476Z","caller":"mvcc/kvstore.go:407","msg":"kvstore restored","current-rev":1} {"level":"info","ts":"2026-05-19T00:01:23.761589Z","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-05-19T00:01:23.765297Z","caller":"etcdserver/server.go:860","msg":"starting etcd server","local-member-id":"4e98569549cc430c","local-server-version":"3.5.12","cluster-version":"to_be_decided"} {"level":"info","ts":"2026-05-19T00:01:23.765779Z","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-05-19T00:01:23.765861Z","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-05-19T00:01:23.765872Z","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-05-19T00:01:23.7659Z","caller":"etcdserver/server.go:744","msg":"started as single-node; fast-forwarding election ticks","local-member-id":"4e98569549cc430c","forward-ticks":9,"forward-duration":"900ms","election-ticks":10,"election-timeout":"1s"} {"level":"info","ts":"2026-05-19T00:01:23.769095Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"4e98569549cc430c switched to configuration voters=(5663371730606637836)"} {"level":"info","ts":"2026-05-19T00:01:23.769421Z","caller":"membership/cluster.go:421","msg":"added member","cluster-id":"65d70b4d1d4a8bf9","local-member-id":"4e98569549cc430c","added-peer-id":"4e98569549cc430c","added-peer-peer-urls":["https://199.204.45.216:2380"]} {"level":"info","ts":"2026-05-19T00:01:23.773587Z","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-05-19T00:01:23.773789Z","caller":"embed/etcd.go:597","msg":"serving peer traffic","address":"199.204.45.216:2380"} {"level":"info","ts":"2026-05-19T00:01:23.773859Z","caller":"embed/etcd.go:569","msg":"cmux::serve","address":"199.204.45.216:2380"} {"level":"info","ts":"2026-05-19T00:01:23.773941Z","caller":"embed/etcd.go:277","msg":"now serving peer/client/metrics","local-member-id":"4e98569549cc430c","initial-advertise-peer-urls":["https://199.204.45.216:2380"],"listen-peer-urls":["https://199.204.45.216:2380"],"advertise-client-urls":["https://199.204.45.216:2379"],"listen-client-urls":["https://127.0.0.1:2379","https://199.204.45.216:2379"],"listen-metrics-urls":["http://127.0.0.1:2381"]} {"level":"info","ts":"2026-05-19T00:01:23.77399Z","caller":"embed/etcd.go:857","msg":"serving metrics","address":"http://127.0.0.1:2381"} {"level":"info","ts":"2026-05-19T00:01:24.453271Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"4e98569549cc430c is starting a new election at term 1"} {"level":"info","ts":"2026-05-19T00:01:24.453321Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"4e98569549cc430c became pre-candidate at term 1"} {"level":"info","ts":"2026-05-19T00:01:24.453346Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"4e98569549cc430c received MsgPreVoteResp from 4e98569549cc430c at term 1"} {"level":"info","ts":"2026-05-19T00:01:24.453357Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"4e98569549cc430c became candidate at term 2"} {"level":"info","ts":"2026-05-19T00:01:24.453363Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"4e98569549cc430c received MsgVoteResp from 4e98569549cc430c at term 2"} {"level":"info","ts":"2026-05-19T00:01:24.453373Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"4e98569549cc430c became leader at term 2"} {"level":"info","ts":"2026-05-19T00:01:24.453381Z","logger":"raft","caller":"etcdserver/zap_raft.go:77","msg":"raft.node: 4e98569549cc430c elected leader 4e98569549cc430c at term 2"} {"level":"info","ts":"2026-05-19T00:01:24.455534Z","caller":"etcdserver/server.go:2068","msg":"published local member to cluster through raft","local-member-id":"4e98569549cc430c","local-member-attributes":"{Name:instance ClientURLs:[https://199.204.45.216:2379]}","request-path":"/0/members/4e98569549cc430c/attributes","cluster-id":"65d70b4d1d4a8bf9","publish-timeout":"7s"} {"level":"info","ts":"2026-05-19T00:01:24.45557Z","caller":"embed/serve.go:103","msg":"ready to serve client requests"} {"level":"info","ts":"2026-05-19T00:01:24.455539Z","caller":"embed/serve.go:103","msg":"ready to serve client requests"} {"level":"info","ts":"2026-05-19T00:01:24.456549Z","caller":"etcdmain/main.go:44","msg":"notifying init daemon"} {"level":"info","ts":"2026-05-19T00:01:24.456592Z","caller":"etcdmain/main.go:50","msg":"successfully notified init daemon"} {"level":"info","ts":"2026-05-19T00:01:24.458103Z","caller":"embed/serve.go:250","msg":"serving client traffic securely","traffic":"grpc+http","address":"199.204.45.216:2379"} {"level":"info","ts":"2026-05-19T00:01:24.458724Z","caller":"embed/serve.go:250","msg":"serving client traffic securely","traffic":"grpc+http","address":"127.0.0.1:2379"} {"level":"info","ts":"2026-05-19T00:01:24.459094Z","caller":"etcdserver/server.go:2578","msg":"setting up initial cluster version using v2 API","cluster-version":"3.5"} {"level":"info","ts":"2026-05-19T00:01:24.469417Z","caller":"membership/cluster.go:584","msg":"set initial cluster version","cluster-id":"65d70b4d1d4a8bf9","local-member-id":"4e98569549cc430c","cluster-version":"3.5"} {"level":"info","ts":"2026-05-19T00:01:24.469554Z","caller":"api/capability.go:75","msg":"enabled capabilities for version","cluster-version":"3.5"} {"level":"info","ts":"2026-05-19T00:01:24.469598Z","caller":"etcdserver/server.go:2602","msg":"cluster version is updated","cluster-version":"3.5"} {"level":"info","ts":"2026-05-19T00:01:26.266354Z","caller":"traceutil/trace.go:171","msg":"trace[232007643] linearizableReadLoop","detail":"{readStateIndex:11; appliedIndex:5; }","duration":"447.064051ms","start":"2026-05-19T00:01:25.819254Z","end":"2026-05-19T00:01:26.266318Z","steps":["trace[232007643] 'read index received' (duration: 431.187654ms)","trace[232007643] 'applied index is now lower than readState.Index' (duration: 15.875037ms)"],"step_count":2} {"level":"info","ts":"2026-05-19T00:01:26.266527Z","caller":"traceutil/trace.go:171","msg":"trace[979267284] transaction","detail":"{read_only:false; response_revision:3; number_of_response:1; }","duration":"465.280206ms","start":"2026-05-19T00:01:25.801234Z","end":"2026-05-19T00:01:26.266514Z","steps":["trace[979267284] 'process raft request' (duration: 449.141718ms)","trace[979267284] 'compare' (duration: 15.527785ms)"],"step_count":2} {"level":"info","ts":"2026-05-19T00:01:26.266701Z","caller":"traceutil/trace.go:171","msg":"trace[1766757762] transaction","detail":"{read_only:false; response_revision:7; number_of_response:1; }","duration":"465.058397ms","start":"2026-05-19T00:01:25.801607Z","end":"2026-05-19T00:01:26.266665Z","steps":["trace[1766757762] 'process raft request' (duration: 464.646262ms)"],"step_count":1} {"level":"info","ts":"2026-05-19T00:01:26.266806Z","caller":"traceutil/trace.go:171","msg":"trace[616352184] transaction","detail":"{read_only:false; response_revision:4; number_of_response:1; }","duration":"465.40164ms","start":"2026-05-19T00:01:25.801397Z","end":"2026-05-19T00:01:26.266799Z","steps":["trace[616352184] 'process raft request' (duration: 464.667732ms)"],"step_count":1} {"level":"info","ts":"2026-05-19T00:01:26.266811Z","caller":"traceutil/trace.go:171","msg":"trace[682943207] transaction","detail":"{read_only:false; response_revision:8; number_of_response:1; }","duration":"465.133039ms","start":"2026-05-19T00:01:25.801612Z","end":"2026-05-19T00:01:26.266745Z","steps":["trace[682943207] 'process raft request' (duration: 464.669482ms)"],"step_count":1} {"level":"warn","ts":"2026-05-19T00:01:26.267299Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"465.802495ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/namespaces/kube-system\" ","response":"range_response_count:0 size:4"} {"level":"info","ts":"2026-05-19T00:01:26.267594Z","caller":"traceutil/trace.go:171","msg":"trace[1976595551] range","detail":"{range_begin:/registry/namespaces/kube-system; range_end:; response_count:0; response_revision:8; }","duration":"466.45344ms","start":"2026-05-19T00:01:25.801018Z","end":"2026-05-19T00:01:26.267471Z","steps":["trace[1976595551] 'agreement among raft nodes before linearized reading' (duration: 465.687561ms)"],"step_count":1} {"level":"warn","ts":"2026-05-19T00:01:26.267636Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"485.724803ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/namespaces/kube-system\" ","response":"range_response_count:0 size:4"} {"level":"warn","ts":"2026-05-19T00:01:26.267665Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-19T00:01:25.800998Z","time spent":"466.647296ms","remote":"127.0.0.1:50574","response type":"/etcdserverpb.KV/Range","request count":0,"request size":34,"response count":0,"response size":26,"request content":"key:\"/registry/namespaces/kube-system\" "} {"level":"info","ts":"2026-05-19T00:01:26.267804Z","caller":"traceutil/trace.go:171","msg":"trace[619774783] range","detail":"{range_begin:/registry/namespaces/kube-system; range_end:; response_count:0; response_revision:8; }","duration":"485.939121ms","start":"2026-05-19T00:01:25.781808Z","end":"2026-05-19T00:01:26.267747Z","steps":["trace[619774783] 'agreement among raft nodes before linearized reading' (duration: 485.0985ms)"],"step_count":1} {"level":"warn","ts":"2026-05-19T00:01:26.267862Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-19T00:01:25.781786Z","time spent":"486.065706ms","remote":"127.0.0.1:50574","response type":"/etcdserverpb.KV/Range","request count":0,"request size":34,"response count":0,"response size":26,"request content":"key:\"/registry/namespaces/kube-system\" "} {"level":"warn","ts":"2026-05-19T00:01:26.267652Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"466.935147ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/masterleases/199.204.45.216\" ","response":"range_response_count:0 size:4"} {"level":"info","ts":"2026-05-19T00:01:26.26864Z","caller":"traceutil/trace.go:171","msg":"trace[2127356406] transaction","detail":"{read_only:false; response_revision:5; number_of_response:1; }","duration":"467.169767ms","start":"2026-05-19T00:01:25.801408Z","end":"2026-05-19T00:01:26.268577Z","steps":["trace[2127356406] 'process raft request' (duration: 464.739525ms)"],"step_count":1} {"level":"info","ts":"2026-05-19T00:01:26.268828Z","caller":"traceutil/trace.go:171","msg":"trace[1229402788] range","detail":"{range_begin:/registry/masterleases/199.204.45.216; range_end:; response_count:0; response_revision:8; }","duration":"468.04753ms","start":"2026-05-19T00:01:25.799973Z","end":"2026-05-19T00:01:26.268021Z","steps":["trace[1229402788] 'agreement among raft nodes before linearized reading' (duration: 466.868185ms)"],"step_count":1} {"level":"warn","ts":"2026-05-19T00:01:26.269597Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-19T00:01:25.799946Z","time spent":"468.992585ms","remote":"127.0.0.1:50510","response type":"/etcdserverpb.KV/Range","request count":0,"request size":39,"response count":0,"response size":26,"request content":"key:\"/registry/masterleases/199.204.45.216\" "} {"level":"warn","ts":"2026-05-19T00:01:26.268724Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-19T00:01:25.801584Z","time spent":"465.347638ms","remote":"127.0.0.1:50956","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":920,"response count":0,"response size":36,"request content":"compare: success:> failure:<>"} {"level":"warn","ts":"2026-05-19T00:01:26.270187Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-19T00:01:25.801393Z","time spent":"467.733548ms","remote":"127.0.0.1:50876","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":698,"response count":0,"response size":36,"request content":"compare: success:> failure:<>"} {"level":"warn","ts":"2026-05-19T00:01:26.270317Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"468.07004ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/resourcequotas/kube-system/\" range_end:\"/registry/resourcequotas/kube-system0\" ","response":"range_response_count:0 size:4"} {"level":"info","ts":"2026-05-19T00:01:26.270399Z","caller":"traceutil/trace.go:171","msg":"trace[32022629] range","detail":"{range_begin:/registry/resourcequotas/kube-system/; range_end:/registry/resourcequotas/kube-system0; response_count:0; response_revision:8; }","duration":"468.638792ms","start":"2026-05-19T00:01:25.801731Z","end":"2026-05-19T00:01:26.27037Z","steps":["trace[32022629] 'agreement among raft nodes before linearized reading' (duration: 466.931888ms)"],"step_count":1} {"level":"warn","ts":"2026-05-19T00:01:26.27044Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-19T00:01:25.801698Z","time spent":"468.732995ms","remote":"127.0.0.1:50552","response type":"/etcdserverpb.KV/Range","request count":0,"request size":78,"response count":0,"response size":26,"request content":"key:\"/registry/resourcequotas/kube-system/\" range_end:\"/registry/resourcequotas/kube-system0\" "} {"level":"warn","ts":"2026-05-19T00:01:26.270524Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-19T00:01:25.801218Z","time spent":"465.350868ms","remote":"127.0.0.1:50956","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":992,"response count":0,"response size":36,"request content":"compare: success:> failure:<>"} {"level":"info","ts":"2026-05-19T00:01:26.271107Z","caller":"traceutil/trace.go:171","msg":"trace[1192954392] transaction","detail":"{read_only:false; response_revision:6; number_of_response:1; }","duration":"469.536486ms","start":"2026-05-19T00:01:25.801547Z","end":"2026-05-19T00:01:26.271084Z","steps":["trace[1192954392] 'process raft request' (duration: 464.672323ms)"],"step_count":1} {"level":"warn","ts":"2026-05-19T00:01:26.271149Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-19T00:01:25.80154Z","time spent":"469.591047ms","remote":"127.0.0.1:50956","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":883,"response count":0,"response size":36,"request content":"compare: success:> failure:<>"} {"level":"warn","ts":"2026-05-19T00:01:26.268664Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"538.821596ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/minions/instance\" ","response":"range_response_count:0 size:4"} {"level":"info","ts":"2026-05-19T00:01:26.271997Z","caller":"traceutil/trace.go:171","msg":"trace[287084094] range","detail":"{range_begin:/registry/minions/instance; range_end:; response_count:0; response_revision:8; }","duration":"542.434962ms","start":"2026-05-19T00:01:25.729484Z","end":"2026-05-19T00:01:26.271919Z","steps":["trace[287084094] 'agreement among raft nodes before linearized reading' (duration: 537.459995ms)"],"step_count":1} {"level":"warn","ts":"2026-05-19T00:01:26.272135Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-19T00:01:25.729481Z","time spent":"542.612979ms","remote":"127.0.0.1:50626","response type":"/etcdserverpb.KV/Range","request count":0,"request size":28,"response count":0,"response size":26,"request content":"key:\"/registry/minions/instance\" "} {"level":"warn","ts":"2026-05-19T00:01:26.272566Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-19T00:01:25.801594Z","time spent":"465.179312ms","remote":"127.0.0.1:50956","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":968,"response count":0,"response size":36,"request content":"compare: success:> failure:<>"} {"level":"warn","ts":"2026-05-19T00:01:26.2727Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-19T00:01:25.801387Z","time spent":"465.433021ms","remote":"127.0.0.1:50956","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":971,"response count":0,"response size":36,"request content":"compare: success:> failure:<>"} {"level":"info","ts":"2026-05-19T00:01:26.306382Z","caller":"traceutil/trace.go:171","msg":"trace[826905509] transaction","detail":"{read_only:false; response_revision:9; number_of_response:1; }","duration":"485.847641ms","start":"2026-05-19T00:01:25.820513Z","end":"2026-05-19T00:01:26.30636Z","steps":["trace[826905509] 'process raft request' (duration: 485.636793ms)"],"step_count":1} {"level":"info","ts":"2026-05-19T00:01:26.306379Z","caller":"traceutil/trace.go:171","msg":"trace[719202270] transaction","detail":"{read_only:false; response_revision:10; number_of_response:1; }","duration":"485.128254ms","start":"2026-05-19T00:01:25.821226Z","end":"2026-05-19T00:01:26.306354Z","steps":["trace[719202270] 'process raft request' (duration: 485.060581ms)"],"step_count":1} {"level":"warn","ts":"2026-05-19T00:01:26.306563Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-19T00:01:25.820491Z","time spent":"485.946385ms","remote":"127.0.0.1:50626","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":3159,"response count":0,"response size":36,"request content":"compare: success:> failure:<>"} {"level":"warn","ts":"2026-05-19T00:01:26.306592Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"485.175786ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/ranges/serviceips\" ","response":"range_response_count:0 size:4"} {"level":"info","ts":"2026-05-19T00:01:26.306653Z","caller":"traceutil/trace.go:171","msg":"trace[1422844376] range","detail":"{range_begin:/registry/ranges/serviceips; range_end:; response_count:0; response_revision:10; }","duration":"485.264429ms","start":"2026-05-19T00:01:25.821373Z","end":"2026-05-19T00:01:26.306638Z","steps":["trace[1422844376] 'agreement among raft nodes before linearized reading' (duration: 485.104043ms)"],"step_count":1} {"level":"warn","ts":"2026-05-19T00:01:26.306656Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"453.661693ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/namespaces/kube-system\" ","response":"range_response_count:0 size:4"} {"level":"info","ts":"2026-05-19T00:01:26.306742Z","caller":"traceutil/trace.go:171","msg":"trace[1693819416] range","detail":"{range_begin:/registry/namespaces/kube-system; range_end:; response_count:0; response_revision:10; }","duration":"453.85596ms","start":"2026-05-19T00:01:25.852874Z","end":"2026-05-19T00:01:26.30673Z","steps":["trace[1693819416] 'agreement among raft nodes before linearized reading' (duration: 453.546668ms)"],"step_count":1} {"level":"warn","ts":"2026-05-19T00:01:26.306844Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-19T00:01:25.852846Z","time spent":"453.989156ms","remote":"127.0.0.1:50574","response type":"/etcdserverpb.KV/Range","request count":0,"request size":34,"response count":0,"response size":26,"request content":"key:\"/registry/namespaces/kube-system\" "} {"level":"warn","ts":"2026-05-19T00:01:26.306695Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-19T00:01:25.82136Z","time spent":"485.327911ms","remote":"127.0.0.1:50536","response type":"/etcdserverpb.KV/Range","request count":0,"request size":29,"response count":0,"response size":26,"request content":"key:\"/registry/ranges/serviceips\" "} {"level":"warn","ts":"2026-05-19T00:01:26.307492Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-19T00:01:25.821196Z","time spent":"485.435766ms","remote":"127.0.0.1:50690","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":849,"response count":0,"response size":36,"request content":"compare: success:> failure:<>"} {"level":"info","ts":"2026-05-19T00:01:54.301638Z","caller":"traceutil/trace.go:171","msg":"trace[701695946] transaction","detail":"{read_only:false; response_revision:505; number_of_response:1; }","duration":"211.994041ms","start":"2026-05-19T00:01:54.089622Z","end":"2026-05-19T00:01:54.301616Z","steps":["trace[701695946] 'process raft request' (duration: 211.873556ms)"],"step_count":1} {"level":"info","ts":"2026-05-19T00:01:54.308285Z","caller":"traceutil/trace.go:171","msg":"trace[868582618] transaction","detail":"{read_only:false; response_revision:506; number_of_response:1; }","duration":"175.253075ms","start":"2026-05-19T00:01:54.133016Z","end":"2026-05-19T00:01:54.308269Z","steps":["trace[868582618] 'process raft request' (duration: 174.662622ms)"],"step_count":1} {"level":"info","ts":"2026-05-19T00:01:54.308484Z","caller":"traceutil/trace.go:171","msg":"trace[987774767] transaction","detail":"{read_only:false; response_revision:507; number_of_response:1; }","duration":"173.33994ms","start":"2026-05-19T00:01:54.135137Z","end":"2026-05-19T00:01:54.308477Z","steps":["trace[987774767] 'process raft request' (duration: 172.613742ms)"],"step_count":1} {"level":"info","ts":"2026-05-19T00:01:54.308614Z","caller":"traceutil/trace.go:171","msg":"trace[1868035484] transaction","detail":"{read_only:false; response_revision:508; number_of_response:1; }","duration":"173.423083ms","start":"2026-05-19T00:01:54.135183Z","end":"2026-05-19T00:01:54.308606Z","steps":["trace[1868035484] 'process raft request' (duration: 172.586821ms)"],"step_count":1} {"level":"info","ts":"2026-05-19T00:01:54.308726Z","caller":"traceutil/trace.go:171","msg":"trace[1206236198] transaction","detail":"{read_only:false; response_revision:509; number_of_response:1; }","duration":"163.626211ms","start":"2026-05-19T00:01:54.145095Z","end":"2026-05-19T00:01:54.308721Z","steps":["trace[1206236198] 'process raft request' (duration: 162.694855ms)"],"step_count":1} {"level":"info","ts":"2026-05-19T00:01:54.308786Z","caller":"traceutil/trace.go:171","msg":"trace[88571586] transaction","detail":"{read_only:false; response_revision:510; number_of_response:1; }","duration":"163.634121ms","start":"2026-05-19T00:01:54.145148Z","end":"2026-05-19T00:01:54.308782Z","steps":["trace[88571586] 'process raft request' (duration: 162.662273ms)"],"step_count":1} {"level":"info","ts":"2026-05-19T00:01:54.308832Z","caller":"traceutil/trace.go:171","msg":"trace[747578922] transaction","detail":"{read_only:false; response_revision:511; number_of_response:1; }","duration":"161.512068ms","start":"2026-05-19T00:01:54.147315Z","end":"2026-05-19T00:01:54.308827Z","steps":["trace[747578922] 'process raft request' (duration: 160.514999ms)"],"step_count":1} {"level":"info","ts":"2026-05-19T00:01:54.308876Z","caller":"traceutil/trace.go:171","msg":"trace[742657362] transaction","detail":"{read_only:false; response_revision:512; number_of_response:1; }","duration":"161.007759ms","start":"2026-05-19T00:01:54.147864Z","end":"2026-05-19T00:01:54.308872Z","steps":["trace[742657362] 'process raft request' (duration: 159.984249ms)"],"step_count":1} {"level":"info","ts":"2026-05-19T00:01:54.308943Z","caller":"traceutil/trace.go:171","msg":"trace[311482623] transaction","detail":"{read_only:false; response_revision:513; number_of_response:1; }","duration":"159.00315ms","start":"2026-05-19T00:01:54.149932Z","end":"2026-05-19T00:01:54.308935Z","steps":["trace[311482623] 'process raft request' (duration: 157.933849ms)"],"step_count":1} {"level":"info","ts":"2026-05-19T00:01:54.309Z","caller":"traceutil/trace.go:171","msg":"trace[20127680] transaction","detail":"{read_only:false; response_revision:514; number_of_response:1; }","duration":"153.798887ms","start":"2026-05-19T00:01:54.155196Z","end":"2026-05-19T00:01:54.308995Z","steps":["trace[20127680] 'process raft request' (duration: 152.688673ms)"],"step_count":1} {"level":"info","ts":"2026-05-19T00:01:54.309038Z","caller":"traceutil/trace.go:171","msg":"trace[642160091] transaction","detail":"{read_only:false; response_revision:515; number_of_response:1; }","duration":"132.001906ms","start":"2026-05-19T00:01:54.177033Z","end":"2026-05-19T00:01:54.309035Z","steps":["trace[642160091] 'process raft request' (duration: 130.882803ms)"],"step_count":1} {"level":"info","ts":"2026-05-19T00:01:54.309085Z","caller":"traceutil/trace.go:171","msg":"trace[593571153] transaction","detail":"{read_only:false; response_revision:516; number_of_response:1; }","duration":"117.569592ms","start":"2026-05-19T00:01:54.19151Z","end":"2026-05-19T00:01:54.30908Z","steps":["trace[593571153] 'process raft request' (duration: 116.456789ms)"],"step_count":1} {"level":"info","ts":"2026-05-19T00:01:54.753283Z","caller":"traceutil/trace.go:171","msg":"trace[1472566565] transaction","detail":"{read_only:false; response_revision:545; number_of_response:1; }","duration":"280.60175ms","start":"2026-05-19T00:01:54.472656Z","end":"2026-05-19T00:01:54.753257Z","steps":["trace[1472566565] 'process raft request' (duration: 275.976009ms)"],"step_count":1} {"level":"info","ts":"2026-05-19T00:01:54.755107Z","caller":"traceutil/trace.go:171","msg":"trace[996459871] transaction","detail":"{read_only:false; response_revision:546; number_of_response:1; }","duration":"275.021472ms","start":"2026-05-19T00:01:54.478914Z","end":"2026-05-19T00:01:54.753936Z","steps":["trace[996459871] 'process raft request' (duration: 274.734961ms)"],"step_count":1} {"level":"info","ts":"2026-05-19T00:01:54.755522Z","caller":"traceutil/trace.go:171","msg":"trace[1601978593] transaction","detail":"{read_only:false; response_revision:547; number_of_response:1; }","duration":"272.335837ms","start":"2026-05-19T00:01:54.483144Z","end":"2026-05-19T00:01:54.75548Z","steps":["trace[1601978593] 'process raft request' (duration: 270.672252ms)"],"step_count":1} {"level":"info","ts":"2026-05-19T00:01:54.755912Z","caller":"traceutil/trace.go:171","msg":"trace[1600531561] linearizableReadLoop","detail":"{readStateIndex:568; appliedIndex:565; }","duration":"180.854853ms","start":"2026-05-19T00:01:54.575005Z","end":"2026-05-19T00:01:54.75586Z","steps":["trace[1600531561] 'read index received' (duration: 173.579489ms)","trace[1600531561] 'applied index is now lower than readState.Index' (duration: 7.272744ms)"],"step_count":2} {"level":"warn","ts":"2026-05-19T00:01:54.757376Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"182.359323ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-05-19T00:01:54.757434Z","caller":"traceutil/trace.go:171","msg":"trace[378820751] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:547; }","duration":"182.472087ms","start":"2026-05-19T00:01:54.574946Z","end":"2026-05-19T00:01:54.757419Z","steps":["trace[378820751] 'agreement among raft nodes before linearized reading' (duration: 181.022951ms)"],"step_count":1} {"level":"info","ts":"2026-05-19T00:02:00.86658Z","caller":"traceutil/trace.go:171","msg":"trace[145347502] transaction","detail":"{read_only:false; response_revision:617; number_of_response:1; }","duration":"101.601406ms","start":"2026-05-19T00:02:00.7649Z","end":"2026-05-19T00:02:00.866502Z","steps":["trace[145347502] 'process raft request' (duration: 100.060385ms)"],"step_count":1} {"level":"info","ts":"2026-05-19T00:02:01.146964Z","caller":"traceutil/trace.go:171","msg":"trace[957384834] transaction","detail":"{read_only:false; response_revision:618; number_of_response:1; }","duration":"217.941894ms","start":"2026-05-19T00:02:00.928991Z","end":"2026-05-19T00:02:01.146933Z","steps":["trace[957384834] 'process raft request' (duration: 217.781477ms)"],"step_count":1} {"level":"warn","ts":"2026-05-19T00:02:01.994935Z","caller":"etcdserver/v3_server.go:897","msg":"waiting for ReadIndex response took too long, retrying","sent-request-id":4831410487399230728,"retry-timeout":"500ms"} {"level":"warn","ts":"2026-05-19T00:02:02.185132Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"974.985652ms","expected-duration":"100ms","prefix":"read-only range ","request":"limit:1 serializable:true keys_only:true ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-05-19T00:02:02.18525Z","caller":"traceutil/trace.go:171","msg":"trace[1154097731] range","detail":"{range_begin:; range_end:; response_count:0; response_revision:618; }","duration":"975.113687ms","start":"2026-05-19T00:02:01.21012Z","end":"2026-05-19T00:02:02.185233Z","steps":["trace[1154097731] 'range keys from in-memory index tree' (duration: 974.970202ms)"],"step_count":1} {"level":"warn","ts":"2026-05-19T00:02:02.495108Z","caller":"etcdserver/v3_server.go:897","msg":"waiting for ReadIndex response took too long, retrying","sent-request-id":4831410487399230728,"retry-timeout":"500ms"} {"level":"warn","ts":"2026-05-19T00:02:02.611001Z","caller":"wal/wal.go:805","msg":"slow fdatasync","took":"1.447839136s","expected-duration":"1s"} {"level":"info","ts":"2026-05-19T00:02:02.611415Z","caller":"traceutil/trace.go:171","msg":"trace[1367246936] linearizableReadLoop","detail":"{readStateIndex:641; appliedIndex:640; }","duration":"1.117192736s","start":"2026-05-19T00:02:01.4942Z","end":"2026-05-19T00:02:02.611392Z","steps":["trace[1367246936] 'read index received' (duration: 1.116969177s)","trace[1367246936] 'applied index is now lower than readState.Index' (duration: 222.539µs)"],"step_count":2} {"level":"info","ts":"2026-05-19T00:02:02.611553Z","caller":"traceutil/trace.go:171","msg":"trace[304848857] transaction","detail":"{read_only:false; response_revision:619; number_of_response:1; }","duration":"1.448445731s","start":"2026-05-19T00:02:01.163074Z","end":"2026-05-19T00:02:02.61152Z","steps":["trace[304848857] 'process raft request' (duration: 1.448187691s)"],"step_count":1} {"level":"warn","ts":"2026-05-19T00:02:02.611708Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"1.117498238s","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/pods/kube-system/cilium-zbrgq\" ","response":"range_response_count:1 size:16965"} {"level":"warn","ts":"2026-05-19T00:02:02.611722Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-19T00:02:01.163063Z","time spent":"1.448593176s","remote":"127.0.0.1:50630","response type":"/etcdserverpb.KV/Txn","request count":1,"request size":2735,"response count":0,"response size":38,"request content":"compare: success:> failure:<>"} {"level":"info","ts":"2026-05-19T00:02:02.611742Z","caller":"traceutil/trace.go:171","msg":"trace[1303597370] range","detail":"{range_begin:/registry/pods/kube-system/cilium-zbrgq; range_end:; response_count:1; response_revision:619; }","duration":"1.117597932s","start":"2026-05-19T00:02:01.494135Z","end":"2026-05-19T00:02:02.611733Z","steps":["trace[1303597370] 'agreement among raft nodes before linearized reading' (duration: 1.117381204s)"],"step_count":1} {"level":"warn","ts":"2026-05-19T00:02:02.611779Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-19T00:02:01.494106Z","time spent":"1.117665345s","remote":"127.0.0.1:50630","response type":"/etcdserverpb.KV/Range","request count":0,"request size":41,"response count":1,"response size":16987,"request content":"key:\"/registry/pods/kube-system/cilium-zbrgq\" "} {"level":"warn","ts":"2026-05-19T00:02:02.611818Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"1.03554977s","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"warn","ts":"2026-05-19T00:02:02.611931Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"276.740112ms","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-05-19T00:02:02.611983Z","caller":"traceutil/trace.go:171","msg":"trace[2124260529] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:619; }","duration":"276.809574ms","start":"2026-05-19T00:02:02.33515Z","end":"2026-05-19T00:02:02.611959Z","steps":["trace[2124260529] 'agreement among raft nodes before linearized reading' (duration: 276.749942ms)"],"step_count":1} {"level":"info","ts":"2026-05-19T00:02:02.611959Z","caller":"traceutil/trace.go:171","msg":"trace[910387983] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:619; }","duration":"1.035685986s","start":"2026-05-19T00:02:01.576189Z","end":"2026-05-19T00:02:02.611875Z","steps":["trace[910387983] 'agreement among raft nodes before linearized reading' (duration: 1.03554876s)"],"step_count":1} {"level":"warn","ts":"2026-05-19T00:02:02.612149Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-19T00:02:01.576165Z","time spent":"1.035926795s","remote":"127.0.0.1:50464","response type":"/etcdserverpb.KV/Range","request count":0,"request size":18,"response count":0,"response size":27,"request content":"key:\"/registry/health\" "} {"level":"warn","ts":"2026-05-19T00:02:02.612198Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"234.834665ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/kube-controller-manager\" ","response":"range_response_count:1 size:505"} {"level":"info","ts":"2026-05-19T00:02:02.612228Z","caller":"traceutil/trace.go:171","msg":"trace[205057230] range","detail":"{range_begin:/registry/leases/kube-system/kube-controller-manager; range_end:; response_count:1; response_revision:619; }","duration":"234.896677ms","start":"2026-05-19T00:02:02.377323Z","end":"2026-05-19T00:02:02.612219Z","steps":["trace[205057230] 'agreement among raft nodes before linearized reading' (duration: 234.845075ms)"],"step_count":1} {"level":"warn","ts":"2026-05-19T00:02:02.612294Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"799.553586ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-cp-lock\" ","response":"range_response_count:1 size:434"} {"level":"info","ts":"2026-05-19T00:02:02.612341Z","caller":"traceutil/trace.go:171","msg":"trace[758703856] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:619; }","duration":"799.627709ms","start":"2026-05-19T00:02:01.812702Z","end":"2026-05-19T00:02:02.612329Z","steps":["trace[758703856] 'agreement among raft nodes before linearized reading' (duration: 799.529005ms)"],"step_count":1} {"level":"warn","ts":"2026-05-19T00:02:02.612377Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-19T00:02:01.812691Z","time spent":"799.67951ms","remote":"127.0.0.1:50696","response type":"/etcdserverpb.KV/Range","request count":0,"request size":44,"response count":1,"response size":456,"request content":"key:\"/registry/leases/kube-system/plndr-cp-lock\" "} {"level":"warn","ts":"2026-05-19T00:02:02.612557Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"808.710725ms","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-05-19T00:02:02.61271Z","caller":"traceutil/trace.go:171","msg":"trace[1094442796] range","detail":"{range_begin:/registry/leases/kube-system/plndr-svcs-lock; range_end:; response_count:1; response_revision:619; }","duration":"808.867811ms","start":"2026-05-19T00:02:01.803781Z","end":"2026-05-19T00:02:02.612649Z","steps":["trace[1094442796] 'agreement among raft nodes before linearized reading' (duration: 808.609281ms)"],"step_count":1} {"level":"warn","ts":"2026-05-19T00:02:02.612809Z","caller":"v3rpc/interceptor.go:197","msg":"request stats","start time":"2026-05-19T00:02:01.803758Z","time spent":"809.033838ms","remote":"127.0.0.1:50696","response type":"/etcdserverpb.KV/Range","request count":0,"request size":46,"response count":1,"response size":460,"request content":"key:\"/registry/leases/kube-system/plndr-svcs-lock\" "} {"level":"info","ts":"2026-05-19T00:02:02.722425Z","caller":"traceutil/trace.go:171","msg":"trace[1192439344] transaction","detail":"{read_only:false; response_revision:622; number_of_response:1; }","duration":"102.928623ms","start":"2026-05-19T00:02:02.61946Z","end":"2026-05-19T00:02:02.722389Z","steps":["trace[1192439344] 'process raft request' (duration: 102.803088ms)"],"step_count":1} {"level":"info","ts":"2026-05-19T00:02:02.722467Z","caller":"traceutil/trace.go:171","msg":"trace[47796853] transaction","detail":"{read_only:false; response_revision:621; number_of_response:1; }","duration":"103.142952ms","start":"2026-05-19T00:02:02.619294Z","end":"2026-05-19T00:02:02.722437Z","steps":["trace[47796853] 'process raft request' (duration: 102.869691ms)"],"step_count":1} {"level":"info","ts":"2026-05-19T00:02:02.72248Z","caller":"traceutil/trace.go:171","msg":"trace[452463302] linearizableReadLoop","detail":"{readStateIndex:649; appliedIndex:641; }","duration":"100.444806ms","start":"2026-05-19T00:02:02.622018Z","end":"2026-05-19T00:02:02.722463Z","steps":["trace[452463302] 'read index received' (duration: 61.85097ms)","trace[452463302] 'applied index is now lower than readState.Index' (duration: 38.591566ms)"],"step_count":2} {"level":"warn","ts":"2026-05-19T00:02:02.722586Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"100.54888ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/health\" ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-05-19T00:02:02.722614Z","caller":"traceutil/trace.go:171","msg":"trace[1163852472] range","detail":"{range_begin:/registry/health; range_end:; response_count:0; response_revision:628; }","duration":"100.616653ms","start":"2026-05-19T00:02:02.62199Z","end":"2026-05-19T00:02:02.722607Z","steps":["trace[1163852472] 'agreement among raft nodes before linearized reading' (duration: 100.53868ms)"],"step_count":1} {"level":"info","ts":"2026-05-19T00:02:02.722745Z","caller":"traceutil/trace.go:171","msg":"trace[315355246] transaction","detail":"{read_only:false; response_revision:625; number_of_response:1; }","duration":"103.062629ms","start":"2026-05-19T00:02:02.619655Z","end":"2026-05-19T00:02:02.722718Z","steps":["trace[315355246] 'process raft request' (duration: 102.701925ms)"],"step_count":1} {"level":"info","ts":"2026-05-19T00:02:02.722769Z","caller":"traceutil/trace.go:171","msg":"trace[1984475673] transaction","detail":"{read_only:false; response_revision:627; number_of_response:1; }","duration":"102.255557ms","start":"2026-05-19T00:02:02.620488Z","end":"2026-05-19T00:02:02.722744Z","steps":["trace[1984475673] 'process raft request' (duration: 101.919504ms)"],"step_count":1} {"level":"info","ts":"2026-05-19T00:02:02.722809Z","caller":"traceutil/trace.go:171","msg":"trace[1057101715] transaction","detail":"{read_only:false; response_revision:626; number_of_response:1; }","duration":"102.941934ms","start":"2026-05-19T00:02:02.619844Z","end":"2026-05-19T00:02:02.722786Z","steps":["trace[1057101715] 'process raft request' (duration: 102.545008ms)"],"step_count":1} {"level":"info","ts":"2026-05-19T00:02:02.722824Z","caller":"traceutil/trace.go:171","msg":"trace[1913492360] transaction","detail":"{read_only:false; response_revision:623; number_of_response:1; }","duration":"103.224205ms","start":"2026-05-19T00:02:02.619591Z","end":"2026-05-19T00:02:02.722815Z","steps":["trace[1913492360] 'process raft request' (duration: 102.714505ms)"],"step_count":1} {"level":"info","ts":"2026-05-19T00:02:02.722855Z","caller":"traceutil/trace.go:171","msg":"trace[1089385035] transaction","detail":"{read_only:false; response_revision:624; number_of_response:1; }","duration":"103.296648ms","start":"2026-05-19T00:02:02.61955Z","end":"2026-05-19T00:02:02.722846Z","steps":["trace[1089385035] 'process raft request' (duration: 102.782558ms)"],"step_count":1} {"level":"warn","ts":"2026-05-19T00:02:03.818822Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"431.304204ms","expected-duration":"100ms","prefix":"","request":"header: lease_revoke:","response":"size:27"} {"level":"warn","ts":"2026-05-19T00:02:04.84579Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"150.490979ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/gateway.envoyproxy.io/httproutefilters/\" range_end:\"/registry/gateway.envoyproxy.io/httproutefilters0\" limit:500 ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-05-19T00:02:04.845841Z","caller":"traceutil/trace.go:171","msg":"trace[1190052029] range","detail":"{range_begin:/registry/gateway.envoyproxy.io/httproutefilters/; range_end:/registry/gateway.envoyproxy.io/httproutefilters0; response_count:0; response_revision:632; }","duration":"150.553831ms","start":"2026-05-19T00:02:04.695274Z","end":"2026-05-19T00:02:04.845828Z","steps":["trace[1190052029] 'range keys from in-memory index tree' (duration: 150.434786ms)"],"step_count":1} {"level":"warn","ts":"2026-05-19T00:02:04.845919Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"118.664427ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/kube-controller-manager\" ","response":"range_response_count:1 size:505"} {"level":"info","ts":"2026-05-19T00:02:04.845937Z","caller":"traceutil/trace.go:171","msg":"trace[1389421452] range","detail":"{range_begin:/registry/leases/kube-system/kube-controller-manager; range_end:; response_count:1; response_revision:632; }","duration":"118.709789ms","start":"2026-05-19T00:02:04.727222Z","end":"2026-05-19T00:02:04.845932Z","steps":["trace[1389421452] 'range keys from in-memory index tree' (duration: 118.545832ms)"],"step_count":1} {"level":"warn","ts":"2026-05-19T00:02:04.845924Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"118.186528ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/gateway.networking.k8s.io/tlsroutes/\" range_end:\"/registry/gateway.networking.k8s.io/tlsroutes0\" count_only:true ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-05-19T00:02:04.845991Z","caller":"traceutil/trace.go:171","msg":"trace[2128472000] range","detail":"{range_begin:/registry/gateway.networking.k8s.io/tlsroutes/; range_end:/registry/gateway.networking.k8s.io/tlsroutes0; response_count:0; response_revision:632; }","duration":"118.248421ms","start":"2026-05-19T00:02:04.727724Z","end":"2026-05-19T00:02:04.845972Z","steps":["trace[2128472000] 'count revisions from in-memory index tree' (duration: 118.156187ms)"],"step_count":1} {"level":"warn","ts":"2026-05-19T00:02:04.846033Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"151.484808ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/gateway.envoyproxy.io/httproutefilters/\" range_end:\"/registry/gateway.envoyproxy.io/httproutefilters0\" limit:10000 ","response":"range_response_count:0 size:5"} {"level":"warn","ts":"2026-05-19T00:02:04.845876Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"118.678177ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/leases/kube-system/plndr-cp-lock\" ","response":"range_response_count:1 size:434"} {"level":"info","ts":"2026-05-19T00:02:04.846104Z","caller":"traceutil/trace.go:171","msg":"trace[1579240959] range","detail":"{range_begin:/registry/gateway.envoyproxy.io/httproutefilters/; range_end:/registry/gateway.envoyproxy.io/httproutefilters0; response_count:0; response_revision:632; }","duration":"151.596372ms","start":"2026-05-19T00:02:04.694491Z","end":"2026-05-19T00:02:04.846087Z","steps":["trace[1579240959] 'range keys from in-memory index tree' (duration: 151.411216ms)"],"step_count":1} {"level":"warn","ts":"2026-05-19T00:02:04.846145Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"118.974429ms","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-05-19T00:02:04.846165Z","caller":"traceutil/trace.go:171","msg":"trace[658293270] range","detail":"{range_begin:/registry/leases/kube-system/plndr-svcs-lock; range_end:; response_count:1; response_revision:632; }","duration":"119.00869ms","start":"2026-05-19T00:02:04.727152Z","end":"2026-05-19T00:02:04.846161Z","steps":["trace[658293270] 'range keys from in-memory index tree' (duration: 118.908646ms)"],"step_count":1} {"level":"info","ts":"2026-05-19T00:02:04.846174Z","caller":"traceutil/trace.go:171","msg":"trace[2043377285] range","detail":"{range_begin:/registry/leases/kube-system/plndr-cp-lock; range_end:; response_count:1; response_revision:632; }","duration":"118.936548ms","start":"2026-05-19T00:02:04.727183Z","end":"2026-05-19T00:02:04.846119Z","steps":["trace[2043377285] 'range keys from in-memory index tree' (duration: 118.550442ms)"],"step_count":1} {"level":"warn","ts":"2026-05-19T00:02:04.846357Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"151.724968ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/gateway.envoyproxy.io/httproutefilters/\" range_end:\"/registry/gateway.envoyproxy.io/httproutefilters0\" count_only:true ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-05-19T00:02:04.846377Z","caller":"traceutil/trace.go:171","msg":"trace[855492003] range","detail":"{range_begin:/registry/gateway.envoyproxy.io/httproutefilters/; range_end:/registry/gateway.envoyproxy.io/httproutefilters0; response_count:0; response_revision:632; }","duration":"151.850292ms","start":"2026-05-19T00:02:04.694522Z","end":"2026-05-19T00:02:04.846373Z","steps":["trace[855492003] 'count revisions from in-memory index tree' (duration: 151.687316ms)"],"step_count":1} {"level":"warn","ts":"2026-05-19T00:02:04.846407Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"119.00581ms","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-05-19T00:02:04.846462Z","caller":"traceutil/trace.go:171","msg":"trace[207029547] range","detail":"{range_begin:/registry/leases/kube-system/kube-scheduler; range_end:; response_count:1; response_revision:632; }","duration":"119.071203ms","start":"2026-05-19T00:02:04.727378Z","end":"2026-05-19T00:02:04.846449Z","steps":["trace[207029547] 'range keys from in-memory index tree' (duration: 118.915697ms)"],"step_count":1} {"level":"warn","ts":"2026-05-19T00:02:04.845861Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"118.215139ms","expected-duration":"100ms","prefix":"read-only range ","request":"key:\"/registry/gateway.networking.k8s.io/tlsroutes/\" range_end:\"/registry/gateway.networking.k8s.io/tlsroutes0\" limit:10000 ","response":"range_response_count:0 size:5"} {"level":"info","ts":"2026-05-19T00:02:04.846757Z","caller":"traceutil/trace.go:171","msg":"trace[286266672] range","detail":"{range_begin:/registry/gateway.networking.k8s.io/tlsroutes/; range_end:/registry/gateway.networking.k8s.io/tlsroutes0; response_count:0; response_revision:632; }","duration":"119.095914ms","start":"2026-05-19T00:02:04.727607Z","end":"2026-05-19T00:02:04.846703Z","steps":["trace[286266672] 'range keys from in-memory index tree' (duration: 118.154117ms)"],"step_count":1} {"level":"warn","ts":"2026-05-19T00:02:19.578751Z","caller":"etcdserver/util.go:170","msg":"apply request took too long","took":"293.775223ms","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":"info","ts":"2026-05-19T00:02:19.578854Z","caller":"traceutil/trace.go:171","msg":"trace[1680338787] range","detail":"{range_begin:/registry/leases/kube-system/cilium-operator-resource-lock; range_end:; response_count:1; response_revision:784; }","duration":"293.952433ms","start":"2026-05-19T00:02:19.28488Z","end":"2026-05-19T00:02:19.578833Z","steps":["trace[1680338787] 'range keys from in-memory index tree' (duration: 293.580991ms)"],"step_count":1}