[11:18:59.378] New invocation is queued and will start shortly
[11:18:59.378] Triggered by user:chromium-ci-builder@chops-service-accounts.iam.gserviceaccount.com
[11:19:00.663] Starting the invocation (attempt 1)
[11:19:00.689] Popped buildset tag "buildset:commit/gitiles/chromium.googlesource.com/chromium/src/+/056a6c9ec7f746dca81b0f736f2154c218a19654"
[11:19:00.689] Popped gitiles commit info from properties and tags
[11:19:00.689] Preparing PubSub topic for "https://cr-buildbucket.appspot.com"
[11:19:00.689] PubSub topic is "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
[11:19:00.689] Buildbucket request:
{
"requestId": "8928889177729109952",
"builder": {
"project": "chromium",
"bucket": "ci",
"builder": "win10-32-on-64-updater-tester-dbg"
},
"properties": {
"$bootstrap/trigger": {
"commits": [
{
"host": "chromium.googlesource.com",
"id": "056a6c9ec7f746dca81b0f736f2154c218a19654",
"project": "chromium/src",
"ref": "refs/heads/main"
}
]
},
"deps_revision_overrides": {
"src": "056a6c9ec7f746dca81b0f736f2154c218a19654"
},
"parent_build_id": "8763459897516012145",
"parent_builder_group": "chromium.updater",
"parent_buildername": "win32-updater-builder-dbg",
"parent_got_angle_revision": "1bdb403899f2040a7b816b3261f13a48914d439c",
"parent_got_dawn_revision": "cdfcfcabd1400a1552ba7d3c6a92dbb28a83fd76",
"parent_got_revision": "056a6c9ec7f746dca81b0f736f2154c218a19654",
"parent_got_revision_cp": "refs/heads/main@{#1228955}",
"parent_got_swiftshader_revision": "50dbfc35468c1ffa037e3e90bc71327d16a5e0cc",
"parent_got_v8_revision": "34503e45094863db86a81e71dd4e9ebe0011d986",
"parent_got_v8_revision_cp": "refs/heads/12.1.221@{#1}",
"parent_got_webrtc_revision": "5116ad58b15b7d56aecc377d06765c3200242b3e",
"parent_got_webrtc_revision_cp": "refs/heads/main@{#41236}",
"swarm_hashes": {
"updater_tests": "2c697125ef22191aaa4d7439f64740868bc9e7457e79d0f6a4b2cc56d0aee825/565",
"updater_tests_system": "58e0ab99b4604d1e2dff714cc68caf8831e202c80000848d862686fb926245ea/565"
},
"swarming_command_lines_cwd": "out\\Debug_x64",
"swarming_command_lines_digest": "a1fec6b6104ff15529cb6cb2e3066c9931580e74dee8f2ba51deef9bc773e7eb/93"
},
"gitilesCommit": {
"host": "chromium.googlesource.com",
"project": "chromium/src",
"id": "056a6c9ec7f746dca81b0f736f2154c218a19654",
"ref": "refs/heads/main"
},
"tags": [
{
"key": "scheduler_invocation_id",
"value": "8928889177729109952"
},
{
"key": "scheduler_job_id",
"value": "chromium/win10-32-on-64-updater-tester-dbg"
},
{
"key": "user_agent",
"value": "luci-scheduler"
},
{
"key": "parent_buildername",
"value": "win32-updater-builder-dbg"
},
{
"key": "parent_buildnumber",
"value": "78296"
},
{
"key": "user_agent",
"value": "recipe"
}
],
"notify": {
"pubsubTopic": "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
}
}
[11:19:01.364] Scheduled build:
{
"id": "8763459115630764241",
"builder": {
"project": "chromium",
"bucket": "ci",
"builder": "win10-32-on-64-updater-tester-dbg"
},
"number": 34254,
"createdBy": "project:chromium",
"createTime": "2023-11-25T11:19:00.754720472Z",
"updateTime": "2023-11-25T11:19:00.754720472Z",
"status": "SCHEDULED",
"input": {
"gitilesCommit": {
"host": "chromium.googlesource.com",
"project": "chromium/src",
"id": "056a6c9ec7f746dca81b0f736f2154c218a19654",
"ref": "refs/heads/main"
}
}
}
[11:19:01.364] Task URL: https://cr-buildbucket.appspot.com/build/8763459115630764241
[11:19:01.364] Scheduling timer "check-buildbucket-build-status" (chromium/win10-32-on-64-updater-tester-dbg:8928889177729109952:2:0) after 1m18s
[11:19:02.335] Received PubSub notification, asking Buildbucket for the build status
[11:19:02.365] Build status: SCHEDULED
[11:20:19.389] Handling timer "check-buildbucket-build-status" (chromium/win10-32-on-64-updater-tester-dbg:8928889177729109952:2:0)
[11:20:19.412] Build status: SCHEDULED
[11:20:19.413] Scheduling timer "check-buildbucket-build-status" (chromium/win10-32-on-64-updater-tester-dbg:8928889177729109952:4:0) after 6m55s
[11:24:39.023] Received PubSub notification, asking Buildbucket for the build status
[11:24:39.110] Build status: STARTED
[11:27:14.436] Handling timer "check-buildbucket-build-status" (chromium/win10-32-on-64-updater-tester-dbg:8928889177729109952:4:0)
[11:27:14.461] Build status: STARTED
[11:27:14.461] Scheduling timer "check-buildbucket-build-status" (chromium/win10-32-on-64-updater-tester-dbg:8928889177729109952:6:0) after 4m2s
[11:31:16.475] Handling timer "check-buildbucket-build-status" (chromium/win10-32-on-64-updater-tester-dbg:8928889177729109952:6:0)
[11:31:16.494] Build status: STARTED
[11:31:16.494] Scheduling timer "check-buildbucket-build-status" (chromium/win10-32-on-64-updater-tester-dbg:8928889177729109952:7:0) after 1m39s
[11:32:55.613] Handling timer "check-buildbucket-build-status" (chromium/win10-32-on-64-updater-tester-dbg:8928889177729109952:7:0)
[11:32:55.666] Build status: STARTED
[11:32:55.667] Scheduling timer "check-buildbucket-build-status" (chromium/win10-32-on-64-updater-tester-dbg:8928889177729109952:8:0) after 5m15s
[11:38:10.683] Handling timer "check-buildbucket-build-status" (chromium/win10-32-on-64-updater-tester-dbg:8928889177729109952:8:0)
[11:38:10.713] Build status: STARTED
[11:38:10.713] Scheduling timer "check-buildbucket-build-status" (chromium/win10-32-on-64-updater-tester-dbg:8928889177729109952:9:0) after 2m40s
[11:40:50.731] Handling timer "check-buildbucket-build-status" (chromium/win10-32-on-64-updater-tester-dbg:8928889177729109952:9:0)
[11:40:50.758] Build status: STARTED
[11:40:50.758] Scheduling timer "check-buildbucket-build-status" (chromium/win10-32-on-64-updater-tester-dbg:8928889177729109952:10:0) after 1m46s
[11:42:36.786] Handling timer "check-buildbucket-build-status" (chromium/win10-32-on-64-updater-tester-dbg:8928889177729109952:10:0)
[11:42:36.802] Build status: STARTED
[11:42:36.802] Scheduling timer "check-buildbucket-build-status" (chromium/win10-32-on-64-updater-tester-dbg:8928889177729109952:11:0) after 2m15s
[11:44:51.821] Handling timer "check-buildbucket-build-status" (chromium/win10-32-on-64-updater-tester-dbg:8928889177729109952:11:0)
[11:44:51.850] Build status: STARTED
[11:44:51.850] Scheduling timer "check-buildbucket-build-status" (chromium/win10-32-on-64-updater-tester-dbg:8928889177729109952:12:0) after 7m53s
[11:52:44.924] Handling timer "check-buildbucket-build-status" (chromium/win10-32-on-64-updater-tester-dbg:8928889177729109952:12:0)
[11:52:44.951] Build status: STARTED
[11:52:44.951] Scheduling timer "check-buildbucket-build-status" (chromium/win10-32-on-64-updater-tester-dbg:8928889177729109952:13:0) after 8m38s
[12:01:22.993] Handling timer "check-buildbucket-build-status" (chromium/win10-32-on-64-updater-tester-dbg:8928889177729109952:13:0)
[12:01:23.013] Build status: STARTED
[12:01:23.013] Scheduling timer "check-buildbucket-build-status" (chromium/win10-32-on-64-updater-tester-dbg:8928889177729109952:14:0) after 6m26s
[12:04:46.657] Received PubSub notification, asking Buildbucket for the build status
[12:04:46.691] Build:
{
"id": "8763459115630764241",
"builder": {
"project": "chromium",
"bucket": "ci",
"builder": "win10-32-on-64-updater-tester-dbg"
},
"number": 34254,
"createdBy": "project:chromium",
"createTime": "2023-11-25T11:19:00.754720472Z",
"startTime": "2023-11-25T11:24:18.784342Z",
"endTime": "2023-11-25T12:04:45.835341Z",
"updateTime": "2023-11-25T12:04:45.835341Z",
"status": "SUCCESS",
"input": {
"gitilesCommit": {
"host": "chromium.googlesource.com",
"project": "chromium/src",
"id": "056a6c9ec7f746dca81b0f736f2154c218a19654",
"ref": "refs/heads/main"
}
}
}
[12:04:46.691] Invocation finished in 45m47.320705022s with status SUCCEEDED