[01:38:28.671] New invocation is queued and will start shortly
[01:38:28.671] Triggered by user:chromium-ci-builder@chops-service-accounts.iam.gserviceaccount.com
[01:38:29.857] Starting the invocation (attempt 1)
[01:38:29.884] Popped buildset tag "buildset:commit/gitiles/chromium.googlesource.com/chromium/src/+/8e913eef36489125234097d05aa0420e243419ef"
[01:38:29.884] Popped gitiles commit info from properties and tags
[01:38:29.884] Preparing PubSub topic for "https://cr-buildbucket.appspot.com"
[01:38:29.884] PubSub topic is "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
[01:38:29.884] Buildbucket request:
{
"requestId": "8924486449022676624",
"builder": {
"project": "chromium",
"bucket": "ci",
"builder": "win10-updater-tester-dbg"
},
"properties": {
"$bootstrap/trigger": {
"commits": [
{
"host": "chromium.googlesource.com",
"id": "8e913eef36489125234097d05aa0420e243419ef",
"project": "chromium/src",
"ref": "refs/heads/main"
}
]
},
"deps_revision_overrides": {
"src": "8e913eef36489125234097d05aa0420e243419ef"
},
"parent_build_id": "8759056786191601921",
"parent_builder_group": "chromium.updater",
"parent_buildername": "win-updater-builder-dbg",
"parent_got_angle_revision": "3461be1ae88258d65299f9fd1f86d6f99c5d89e4",
"parent_got_dawn_revision": "a4f3b67789b2ab0682fed9c765a684c59081d8f8",
"parent_got_revision": "8e913eef36489125234097d05aa0420e243419ef",
"parent_got_revision_cp": "refs/heads/main@{#1246793}",
"parent_got_swiftshader_revision": "2fa7e9b99ae4e70ea5ae2cc9c8d3afb43391384f",
"parent_got_v8_revision": "11f98ddf14046d1f417594a4504b96429bccaed3",
"parent_got_v8_revision_cp": "refs/heads/12.2.236@{#1}",
"parent_got_webrtc_revision": "dc48289b46e028e6f64e1f7b4e80585853284cbc",
"parent_got_webrtc_revision_cp": "refs/heads/main@{#41519}",
"swarm_hashes": {
"updater_tests": "362da590c9b2f0279c2865c2287381cf15a088c438a3b15c71bc9231e871bd19/565",
"updater_tests_system": "81991492baf943b1ec2300486b801bd66a0e09f529316ce3e49bf2bc14f251fb/565",
"updater_tests_win_uac": "84ecfa7a4d3a9d3a00fe44a5c55b435eb19443557ef0fc7989e6fc287078e262/565"
},
"swarming_command_lines_cwd": "out\\Debug_x64",
"swarming_command_lines_digest": "04644b3725667de8322112c049e098c517856de3e0dd50fcb242162058d8e657/93"
},
"gitilesCommit": {
"host": "chromium.googlesource.com",
"project": "chromium/src",
"id": "8e913eef36489125234097d05aa0420e243419ef",
"ref": "refs/heads/main"
},
"tags": [
{
"key": "scheduler_invocation_id",
"value": "8924486449022676624"
},
{
"key": "scheduler_job_id",
"value": "chromium/win10-updater-tester-dbg"
},
{
"key": "user_agent",
"value": "luci-scheduler"
},
{
"key": "parent_buildername",
"value": "win-updater-builder-dbg"
},
{
"key": "parent_buildnumber",
"value": "103990"
},
{
"key": "user_agent",
"value": "recipe"
}
],
"notify": {
"pubsubTopic": "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
}
}
[01:38:30.475] Scheduled build:
{
"id": "8759056386998209313",
"builder": {
"project": "chromium",
"bucket": "ci",
"builder": "win10-updater-tester-dbg"
},
"number": 76131,
"createdBy": "project:chromium",
"createTime": "2024-01-13T01:38:29.973332100Z",
"updateTime": "2024-01-13T01:38:29.973332100Z",
"status": "SCHEDULED",
"input": {
"gitilesCommit": {
"host": "chromium.googlesource.com",
"project": "chromium/src",
"id": "8e913eef36489125234097d05aa0420e243419ef",
"ref": "refs/heads/main"
}
}
}
[01:38:30.475] Task URL: https://cr-buildbucket.appspot.com/build/8759056386998209313
[01:38:30.475] Scheduling timer "check-buildbucket-build-status" (chromium/win10-updater-tester-dbg:8924486449022676624:2:0) after 8m53s
[01:38:31.395] Received PubSub notification, asking Buildbucket for the build status
[01:38:31.419] Build status: SCHEDULED
[01:39:06.049] Received PubSub notification, asking Buildbucket for the build status
[01:39:06.078] Build status: STARTED
[01:47:23.527] Handling timer "check-buildbucket-build-status" (chromium/win10-updater-tester-dbg:8924486449022676624:2:0)
[01:47:23.542] Build status: STARTED
[01:47:23.542] Scheduling timer "check-buildbucket-build-status" (chromium/win10-updater-tester-dbg:8924486449022676624:5:0) after 6m52s
[01:54:15.637] Handling timer "check-buildbucket-build-status" (chromium/win10-updater-tester-dbg:8924486449022676624:5:0)
[01:54:15.656] Build status: STARTED
[01:54:15.656] Scheduling timer "check-buildbucket-build-status" (chromium/win10-updater-tester-dbg:8924486449022676624:6:0) after 3m6s
[01:57:21.808] Handling timer "check-buildbucket-build-status" (chromium/win10-updater-tester-dbg:8924486449022676624:6:0)
[01:57:21.827] Build status: STARTED
[01:57:21.827] Scheduling timer "check-buildbucket-build-status" (chromium/win10-updater-tester-dbg:8924486449022676624:7:0) after 3m27s
[02:00:48.940] Handling timer "check-buildbucket-build-status" (chromium/win10-updater-tester-dbg:8924486449022676624:7:0)
[02:00:48.957] Build status: STARTED
[02:00:48.957] Scheduling timer "check-buildbucket-build-status" (chromium/win10-updater-tester-dbg:8924486449022676624:8:0) after 4m52s
[02:05:41.065] Handling timer "check-buildbucket-build-status" (chromium/win10-updater-tester-dbg:8924486449022676624:8:0)
[02:05:41.208] Build status: STARTED
[02:05:41.208] Scheduling timer "check-buildbucket-build-status" (chromium/win10-updater-tester-dbg:8924486449022676624:9:0) after 8m25s
[02:06:45.730] Received PubSub notification, asking Buildbucket for the build status
[02:06:45.749] Build:
{
"id": "8759056386998209313",
"builder": {
"project": "chromium",
"bucket": "ci",
"builder": "win10-updater-tester-dbg"
},
"number": 76131,
"createdBy": "project:chromium",
"createTime": "2024-01-13T01:38:29.973332100Z",
"startTime": "2024-01-13T01:39:04.998059Z",
"endTime": "2024-01-13T02:06:44.814778Z",
"updateTime": "2024-01-13T02:06:44.814778Z",
"status": "SUCCESS",
"input": {
"gitilesCommit": {
"host": "chromium.googlesource.com",
"project": "chromium/src",
"id": "8e913eef36489125234097d05aa0420e243419ef",
"ref": "refs/heads/main"
}
}
}
[02:06:45.749] Invocation finished in 28m17.09082481s with status SUCCEEDED