| 2026-10-26 15:12:29.963 · INFO · cbg-trade · test |
| [main.go:38] Current directory: /app › |
| 2026-10-26 15:12:29.962 · INFO · cbg-trade · test |
| [main.go:30] Starting server, time -> [2026-10-26 15:12:29] › |
| 2026-10-26 15:12:17.272 · INFO · cbg-trade · test |
| [eidtype.go:103] [eid_type] upstream lookup succeeded, eid=202610261500113-378-HRVQN8CNSEFF server_id=378 reason=value status=1 status_code=OK kind_id=40 equip_type=3750 listing_status=2 › |
| 2026-10-26 15:12:14.362 · INFO · cbg-trade · test |
| [random_push_review.go:194] role get random push review, token: DTHF-NURN-3826-3772 › |
| 2026-10-26 15:12:12.672 · INFO · cbg-trade · test |
| [eidtype.go:103] [eid_type] upstream lookup succeeded, eid=202406242300113-132-X4VY3L9YHRWZ server_id=132 reason=value status=1 status_code=OK kind_id=35 equip_type=3745 listing_status=2 › |
| 2026-10-26 15:12:09.161 · INFO · cbg-trade · test |
| [eidtype.go:103] [eid_type] upstream lookup succeeded, eid=202610261500113-622-R5LINRARVB4D server_id=622 reason=value status=1 status_code=OK kind_id=50 equip_type=998 listing_status=2 › |
| 2026-10-26 15:12:05.813 · INFO · cbg-trade · test |
| [eidtype.go:103] [eid_type] upstream lookup succeeded, eid=202610261500113-558-TFEMX4BOEQ7O server_id=558 reason=value status=1 status_code=OK kind_id=32 equip_type=3742 listing_status=2 › |
| 2026-10-26 15:12:03.173 · INFO · cbg-trade · test |
| [eidtype.go:103] [eid_type] upstream lookup succeeded, eid=202610261500113-527-FTCJHSIZ5RYY server_id=527 reason=value status=1 status_code=OK kind_id=30 equip_type=3740 listing_status=2 › |
| 2026-10-26 15:12:02.868 · INFO · cbg-trade · test |
| [producer.go:173] [value-stats] producer buffer=0 sent=3414 dropped=2 › |
| 2026-10-26 15:11:59.253 · INFO · cbg-trade · test |
| [random_push_review.go:194] role get random push review, token: LEFB-KLNO-1775-9446 › |
| 2026-10-26 15:11:58.941 · INFO · cbg-trade · test |
| [main.go:63] Server exit, [2.47 minutes] elapsed › |
| 2026-10-26 15:11:58.931 · INFO · cbg-trade · test |
| [report.go:221] ========== NewRoleCheck 卡顿分析报告 ========== 结果: success 总耗时: 148.200s 角色: 查询 642 / 待处理 618 / 已处理 618 / 成功 618 / 失败 0 / 已标记 7 并发数: 13 吞吐量: 4.17 roles/s 阶段耗时: - 分布式锁: 0.012s - 查询待处理角色: 0.095s - KVrocks状态过滤: 0.039s - 特殊服务器配置加载: 0.000s - worker处理: 147.903s - OpenIM通知: 0.152s 调用统计: - KVrocks状态写入: 7次, 累计 0.325s, 平均 0.046s, P50 0.014s, P95 0.029s, P99 0.029s, 最大 0.242s - roledetail: 618次, 累计 1356.023s, 平均 2.194s, P50 1.539s, P95 6.346s, P99 10.468s, 最大 18.025s - 基础抽签队列写入: 7次, 累计 0.299s, 平均 0.043s, P50 0.047s, P95 0.049s, P99 0.049s, 最大 0.079s - 审核记录写入: 7次, 累计 0.651s, 平均 0.093s, P50 0.091s, P95 0.099s, P99 0.099s, 最大 0.110s - 服务器查询: 7次, 累计 0.000s, 平均 0.000s, P50 0.000s, P95 0.000s, P99 0.000s, 最大 0.000s - 角色估价: 135次, 累计 503.456s, 平均 3.729s, P50 0.582s, P95 15.050s, P99 19.807s, 最大 25.799s 请求明细: - roledetail HTTP请求: 630 - roledetail重试: 12 - roledetail重试成功: 12 - roledetail首次成功: 606 worker负载: - worker 1: 50件, 忙碌 145.482s - worker 2: 46件, 忙碌 144.140s - worker 3: 35件, 忙碌 142.904s - worker 4: 52件, 忙碌 141.793s - worker 5: 47件, 忙碌 143.969s - worker 6: 41件, 忙碌 142.769s - worker 7: 60件, 忙碌 141.366s - worker 8: 56件, 忙碌 142.298s - worker 9: 54件, 忙碌 141.810s - worker 10: 46件, 忙碌 142.610s - worker 11: 36件, 忙碌 141.976s - worker 12: 53件, 忙碌 141.743s - worker 13: 42件, 忙碌 147.901s 最慢角色 Top 10: - eid=202607240000113-554-JGQUYM6LN1DO, worker=11, 总耗时=29.013s, roledetail=9.002s, 角色估价=20.011s - eid=202610231900113-730-8BNIHBIP1AAJ, worker=6, 总耗时=26.814s, roledetail=1.015s, 角色估价=25.799s - eid=202610261400113-407-QFV4MRZUSPWL, worker=13, 总耗时=22.407s, roledetail=2.614s, 角色估价=19.793s - eid=202609061800113-132-LXVJ23YOQISY, worker=3, 总耗时=21.963s, roledetail=5.125s, 角色估价=16.839s - eid=202609232300113-326-VB6GRE0QINWW, worker=7, 总耗时=21.674s, roledetail=5.211s, 角色估价=16.463s - eid=202610181900113-584-PG7BV0PWM00R, worker=13, 总耗时=20.644s, roledetail=0.838s, 角色估价=19.807s - eid=202610261400113-954-L7YY6Z1HTVKF, worker=2, 总耗时=18.323s, KVrocks状态写入=0.010s, roledetail=3.292s, 基础抽签队列写入=0.018s, 审核记录写入=0.099s, 服务器查询=0.000s, 角色估价=14.903s - eid=202605260700113-159-JWFDW3OQBHY0, worker=11, 总耗时=18.159s, roledetail=1.476s, 角色估价=16.682s - eid=202610230800113-85-YCC5KYMTNDQBA, worker=4, 总耗时=18.025s, roledetail=18.025s - eid=202610242200113-584-YEAXPC4XDDR8, worker=12, 总耗时=17.647s, roledetail=5.434s, 角色估价=12.212s =============================================== › |
| 2026-10-26 15:11:58.779 · INFO · cbg-trade · test |
| [single_line.go:49] new role check progress: 618/618 › |
| 2026-10-26 15:11:58.538 · INFO · cbg-trade · test |
| [random_push_review.go:194] role get random push review, token: LEFB-KLNO-1775-9446 › |
| 2026-10-26 15:11:58.222 · ERROR · cbg-trade · test |
| [update.go:133] [49/51] worker 1 failed to get item detail, eid: 202610241700113-1018-CYWX7IQQCXA, server_id: 1018, err: detail service: UPSTREAM_ERROR (HTTP 502) › |
| 2026-10-26 15:11:58.222 · INFO · cbg-trade · test |
| [update.go:191] update success › |
| 2026-10-26 15:11:58.222 · ERROR · cbg-trade · test |
| [update.go:133] [48/51] worker 4 failed to get item detail, eid: 202610241700113-1018-CYWX7IQQCXA, server_id: 1018, err: detail service: UPSTREAM_ERROR (HTTP 502) › |
| 2026-10-26 15:11:58.222 · INFO · cbg-trade · test |
| [main.go:63] Server exit, [0.47 minutes] elapsed › |
| 2026-10-26 15:11:58.222 · INFO · cbg-trade · test |
| [update.go:176] updated 45/51 random push reviews › |
| 2026-10-26 15:11:55.996 · INFO · cbg-trade · test |
| [eidtype.go:103] [eid_type] upstream lookup succeeded, eid=202610261500113-926-XDE5V1WGJOCG server_id=926 reason=value status=1 status_code=OK kind_id=90 equip_type=63047 listing_status=2 › |