[21:54:48.322] New invocation is queued and will start shortly
[21:54:49.432] Starting the invocation (attempt 1)
[21:54:49.531] Preparing PubSub topic for "https://cr-buildbucket.appspot.com"
[21:54:49.531] PubSub topic is "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
[21:54:49.533] Buildbucket request:
{
"bucket": "luci.dart.ci.sandbox",
"client_operation_id": "9030136584103782112",
"parameters_json": "{\"builder_name\":\"gclient\",\"properties\":{\"$recipe_engine/scheduler\":{\"hostname\":\"luci-scheduler.appspot.com\",\"triggers\":[{\"gitiles\":{\"ref\":\"refs/heads/master\",\"repo\":\"https://dart.googlesource.com/sdk\",\"revision\":\"ab7dc265d780f5fd018f06860f270d54a4536f01\"},\"id\":\"https://dart.googlesource.com/sdk/+/refs/heads/master@ab7dc265d780f5fd018f06860f270d54a4536f01\",\"title\":\"ab7dc265d780f5fd018f06860f270d54a4536f01\",\"url\":\"https://dart.googlesource.com/sdk/+/ab7dc265d780f5fd018f06860f270d54a4536f01\"},{\"gitiles\":{\"ref\":\"refs/heads/master\",\"repo\":\"https://dart.googlesource.com/sdk\",\"revision\":\"47b5a1e9f533da24579752fe6af910a58ef4f5d8\"},\"id\":\"https://dart.googlesource.com/sdk/+/refs/heads/master@47b5a1e9f533da24579752fe6af910a58ef4f5d8\",\"title\":\"47b5a1e9f533da24579752fe6af910a58ef4f5d8\",\"url\":\"https://dart.googlesource.com/sdk/+/47b5a1e9f533da24579752fe6af910a58ef4f5d8\"}]},\"branch\":\"refs/heads/master\",\"repository\":\"https://dart.googlesource.com/sdk\",\"revision\":\"47b5a1e9f533da24579752fe6af910a58ef4f5d8\"}}",
"pubsub_callback": {
"auth_token": "...",
"topic": "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
},
"tags": [
"builder:gclient",
"scheduler_invocation_id:9030136584103782112",
"scheduler_job_id:dart/gclient",
"user_agent:luci-scheduler",
"buildset:commit/git/47b5a1e9f533da24579752fe6af910a58ef4f5d8",
"buildset:commit/gitiles/dart.googlesource.com/sdk/+/47b5a1e9f533da24579752fe6af910a58ef4f5d8",
"gitiles_ref:refs/heads/master"
]
}
[21:54:50.349] Buildbucket response:
{
"build": {
"bucket": "luci.dart.ci.sandbox",
"canary_preference": "PROD",
"created_by": "project:dart",
"created_ts": "1604354089703806",
"id": "8864706521993636640",
"parameters_json": "{\"builder_name\": \"gclient\", \"properties\": {\"$recipe_engine/scheduler\": {\"hostname\": \"luci-scheduler.appspot.com\", \"triggers\": [{\"gitiles\": {\"ref\": \"refs/heads/master\", \"repo\": \"https://dart.googlesource.com/sdk\", \"revision\": \"ab7dc265d780f5fd018f06860f270d54a4536f01\"}, \"id\": \"https://dart.googlesource.com/sdk/+/refs/heads/master@ab7dc265d780f5fd018f06860f270d54a4536f01\", \"title\": \"ab7dc265d780f5fd018f06860f270d54a4536f01\", \"url\": \"https://dart.googlesource.com/sdk/+/ab7dc265d780f5fd018f06860f270d54a4536f01\"}, {\"gitiles\": {\"ref\": \"refs/heads/master\", \"repo\": \"https://dart.googlesource.com/sdk\", \"revision\": \"47b5a1e9f533da24579752fe6af910a58ef4f5d8\"}, \"id\": \"https://dart.googlesource.com/sdk/+/refs/heads/master@47b5a1e9f533da24579752fe6af910a58ef4f5d8\", \"title\": \"47b5a1e9f533da24579752fe6af910a58ef4f5d8\", \"url\": \"https://dart.googlesource.com/sdk/+/47b5a1e9f533da24579752fe6af910a58ef4f5d8\"}]}, \"branch\": \"refs/heads/master\", \"repository\": \"https://dart.googlesource.com/sdk\", \"revision\": \"47b5a1e9f533da24579752fe6af910a58ef4f5d8\"}}",
"project": "dart",
"result_details_json": "{\"properties\": {}}",
"service_account": "dart-luci-try-builder@dart-ci.iam.gserviceaccount.com",
"status": "SCHEDULED",
"status_changed_ts": "1604354090228691",
"tags": [
"build_address:luci.dart.ci.sandbox/gclient/10567",
"builder:gclient",
"buildset:commit/git/47b5a1e9f533da24579752fe6af910a58ef4f5d8",
"buildset:commit/gitiles/dart.googlesource.com/sdk/+/47b5a1e9f533da24579752fe6af910a58ef4f5d8",
"gitiles_ref:refs/heads/master",
"scheduler_invocation_id:9030136584103782112",
"scheduler_job_id:dart/gclient",
"swarming_hostname:chromium-swarm.appspot.com",
"swarming_tag:log_location:logdog://logs.chromium.org/dart/buildbucket/cr-buildbucket.appspot.com/8864706521993636640/+/annotations",
"swarming_tag:luci_project:dart",
"swarming_tag:recipe_name:dart/gclient",
"swarming_tag:recipe_package:dart/recipe_bundles/dart.googlesource.com/recipes",
"swarming_task_id:",
"user_agent:luci-scheduler"
],
"updated_ts": "1604354090228805",
"url": "https://ci.chromium.org/b/8864706521993636640",
"utcnow_ts": "1604354090340242"
}
}
[21:54:50.349] Task URL: https://ci.chromium.org/b/8864706521993636640
[21:54:50.349] Scheduling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:2:0) after 1m0s
[21:55:31.584] Received PubSub notification, asking Buildbucket for the build status
[21:55:31.694] Build 8864706521993636640: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:55:50.385] Handling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:2:0)
[21:55:50.385] Timer tick, asking Buildbucket for the build status
[21:55:50.665] Build 8864706521993636640: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:55:50.665] Scheduling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:4:0) after 1m0s
[21:56:50.688] Handling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:4:0)
[21:56:50.688] Timer tick, asking Buildbucket for the build status
[21:56:51.033] Build 8864706521993636640: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:56:51.033] Scheduling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:5:0) after 1m0s
[21:57:51.086] Handling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:5:0)
[21:57:51.086] Timer tick, asking Buildbucket for the build status
[21:57:51.177] Build 8864706521993636640: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:57:51.177] Scheduling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:6:0) after 1m0s
[21:58:51.178] Handling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:6:0)
[21:58:51.178] Timer tick, asking Buildbucket for the build status
[21:58:51.267] Build 8864706521993636640: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:58:51.267] Scheduling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:7:0) after 1m0s
[21:59:51.297] Handling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:7:0)
[21:59:51.297] Timer tick, asking Buildbucket for the build status
[21:59:51.586] Build 8864706521993636640: status "STARTED", result "", failure_reason "", cancelation_reason ""
[21:59:51.586] Scheduling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:8:0) after 1m0s
[22:00:51.688] Handling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:8:0)
[22:00:51.688] Timer tick, asking Buildbucket for the build status
[22:00:51.836] Build 8864706521993636640: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:00:51.836] Scheduling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:9:0) after 1m0s
[22:01:51.819] Handling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:9:0)
[22:01:51.819] Timer tick, asking Buildbucket for the build status
[22:01:51.888] Build 8864706521993636640: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:01:51.888] Scheduling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:10:0) after 1m0s
[22:02:52.009] Handling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:10:0)
[22:02:52.009] Timer tick, asking Buildbucket for the build status
[22:02:52.461] Build 8864706521993636640: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:02:52.461] Scheduling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:11:0) after 1m0s
[22:03:52.532] Handling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:11:0)
[22:03:52.532] Timer tick, asking Buildbucket for the build status
[22:03:52.622] Build 8864706521993636640: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:03:52.622] Scheduling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:12:0) after 1m0s
[22:04:52.698] Handling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:12:0)
[22:04:52.698] Timer tick, asking Buildbucket for the build status
[22:04:52.830] Build 8864706521993636640: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:04:52.830] Scheduling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:13:0) after 1m0s
[22:05:52.937] Handling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:13:0)
[22:05:52.937] Timer tick, asking Buildbucket for the build status
[22:05:53.037] Build 8864706521993636640: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:05:53.037] Scheduling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:14:0) after 1m0s
[22:06:53.099] Handling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:14:0)
[22:06:53.099] Timer tick, asking Buildbucket for the build status
[22:06:53.308] Build 8864706521993636640: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:06:53.308] Scheduling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:15:0) after 1m0s
[22:07:53.326] Handling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:15:0)
[22:07:53.326] Timer tick, asking Buildbucket for the build status
[22:07:53.394] Build 8864706521993636640: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:07:53.394] Scheduling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:16:0) after 1m0s
[22:08:53.426] Handling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:16:0)
[22:08:53.426] Timer tick, asking Buildbucket for the build status
[22:08:53.528] Build 8864706521993636640: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:08:53.528] Scheduling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:17:0) after 1m0s
[22:09:53.577] Handling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:17:0)
[22:09:53.577] Timer tick, asking Buildbucket for the build status
[22:09:53.942] Build 8864706521993636640: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:09:53.942] Scheduling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:18:0) after 1m0s
[22:10:53.971] Handling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:18:0)
[22:10:53.971] Timer tick, asking Buildbucket for the build status
[22:10:54.412] Build 8864706521993636640: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:10:54.412] Scheduling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:19:0) after 1m0s
[22:11:54.396] Handling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:19:0)
[22:11:54.397] Timer tick, asking Buildbucket for the build status
[22:11:54.503] Build 8864706521993636640: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:11:54.503] Scheduling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:20:0) after 1m0s
[22:12:54.524] Handling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:20:0)
[22:12:54.524] Timer tick, asking Buildbucket for the build status
[22:12:54.593] Build 8864706521993636640: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:12:54.593] Scheduling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:21:0) after 1m0s
[22:13:54.629] Handling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:21:0)
[22:13:54.629] Timer tick, asking Buildbucket for the build status
[22:13:54.703] Build 8864706521993636640: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:13:54.703] Scheduling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:22:0) after 1m0s
[22:14:54.758] Handling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:22:0)
[22:14:54.758] Timer tick, asking Buildbucket for the build status
[22:14:54.892] Build 8864706521993636640: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:14:54.892] Scheduling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:23:0) after 1m0s
[22:15:54.943] Handling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:23:0)
[22:15:54.943] Timer tick, asking Buildbucket for the build status
[22:15:55.019] Build 8864706521993636640: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:15:55.019] Scheduling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:24:0) after 1m0s
[22:16:55.151] Handling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:24:0)
[22:16:55.151] Timer tick, asking Buildbucket for the build status
[22:16:55.263] Build 8864706521993636640: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:16:55.263] Scheduling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:25:0) after 1m0s
[22:17:55.284] Handling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:25:0)
[22:17:55.284] Timer tick, asking Buildbucket for the build status
[22:17:55.542] Build 8864706521993636640: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:17:55.542] Scheduling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:26:0) after 1m0s
[22:18:55.573] Handling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:26:0)
[22:18:55.573] Timer tick, asking Buildbucket for the build status
[22:18:55.670] Build 8864706521993636640: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:18:55.670] Scheduling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:27:0) after 1m0s
[22:19:55.712] Handling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:27:0)
[22:19:55.712] Timer tick, asking Buildbucket for the build status
[22:19:55.854] Build 8864706521993636640: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:19:55.854] Scheduling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:28:0) after 1m0s
[22:20:55.876] Handling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:28:0)
[22:20:55.876] Timer tick, asking Buildbucket for the build status
[22:20:55.974] Build 8864706521993636640: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:20:55.974] Scheduling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:29:0) after 1m0s
[22:21:56.003] Handling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:29:0)
[22:21:56.003] Timer tick, asking Buildbucket for the build status
[22:21:56.147] Build 8864706521993636640: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:21:56.147] Scheduling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:30:0) after 1m0s
[22:22:56.141] Handling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:30:0)
[22:22:56.141] Timer tick, asking Buildbucket for the build status
[22:22:56.211] Build 8864706521993636640: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:22:56.211] Scheduling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:31:0) after 1m0s
[22:23:56.240] Handling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:31:0)
[22:23:56.240] Timer tick, asking Buildbucket for the build status
[22:23:56.658] Build 8864706521993636640: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:23:56.658] Scheduling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:32:0) after 1m0s
[22:24:56.634] Handling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:32:0)
[22:24:56.634] Timer tick, asking Buildbucket for the build status
[22:24:57.216] Build 8864706521993636640: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:24:57.216] Scheduling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:33:0) after 1m0s
[22:25:57.237] Handling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:33:0)
[22:25:57.237] Timer tick, asking Buildbucket for the build status
[22:25:57.333] Build 8864706521993636640: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:25:57.334] Scheduling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:34:0) after 1m0s
[22:26:57.551] Handling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:34:0)
[22:26:57.551] Timer tick, asking Buildbucket for the build status
[22:26:57.771] Build 8864706521993636640: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:26:57.771] Scheduling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:35:0) after 1m0s
[22:27:57.855] Handling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:35:0)
[22:27:57.855] Timer tick, asking Buildbucket for the build status
[22:27:57.940] Build 8864706521993636640: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:27:57.940] Scheduling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:36:0) after 1m0s
[22:28:58.003] Handling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:36:0)
[22:28:58.003] Timer tick, asking Buildbucket for the build status
[22:28:58.069] Build 8864706521993636640: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:28:58.069] Scheduling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:37:0) after 1m0s
[22:29:58.395] Handling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:37:0)
[22:29:58.395] Timer tick, asking Buildbucket for the build status
[22:29:58.550] Build 8864706521993636640: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:29:58.550] Scheduling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:38:0) after 1m0s
[22:30:58.622] Handling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:38:0)
[22:30:58.622] Timer tick, asking Buildbucket for the build status
[22:30:58.743] Build 8864706521993636640: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:30:58.743] Scheduling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:39:0) after 1m0s
[22:31:58.780] Handling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:39:0)
[22:31:58.781] Timer tick, asking Buildbucket for the build status
[22:31:59.641] Build 8864706521993636640: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:31:59.641] Scheduling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:40:0) after 1m0s
[22:32:59.711] Handling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:40:0)
[22:32:59.711] Timer tick, asking Buildbucket for the build status
[22:32:59.782] Build 8864706521993636640: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:32:59.782] Scheduling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:41:0) after 1m0s
[22:33:59.779] Handling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:41:0)
[22:33:59.779] Timer tick, asking Buildbucket for the build status
[22:33:59.867] Build 8864706521993636640: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:33:59.867] Scheduling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:42:0) after 1m0s
[22:34:59.861] Handling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:42:0)
[22:34:59.861] Timer tick, asking Buildbucket for the build status
[22:35:00.207] Build 8864706521993636640: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:35:00.207] Scheduling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:43:0) after 1m0s
[22:36:00.217] Handling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:43:0)
[22:36:00.217] Timer tick, asking Buildbucket for the build status
[22:36:00.304] Build 8864706521993636640: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:36:00.304] Scheduling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:44:0) after 1m0s
[22:37:00.756] Handling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:44:0)
[22:37:00.756] Timer tick, asking Buildbucket for the build status
[22:37:00.888] Build 8864706521993636640: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:37:00.888] Scheduling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:45:0) after 1m0s
[22:38:02.465] Handling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:45:0)
[22:38:02.465] Timer tick, asking Buildbucket for the build status
[22:38:02.798] Build 8864706521993636640: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:38:02.798] Scheduling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:46:0) after 1m0s
[22:39:03.066] Handling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:46:0)
[22:39:03.067] Timer tick, asking Buildbucket for the build status
[22:39:03.347] Build 8864706521993636640: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:39:03.347] Scheduling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:47:0) after 1m0s
[22:40:03.582] Handling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:47:0)
[22:40:03.582] Timer tick, asking Buildbucket for the build status
[22:40:04.081] Build 8864706521993636640: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:40:04.081] Scheduling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:48:0) after 1m0s
[22:41:04.329] Handling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:48:0)
[22:41:04.329] Timer tick, asking Buildbucket for the build status
[22:41:04.408] Build 8864706521993636640: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:41:04.408] Scheduling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:49:0) after 1m0s
[22:42:04.483] Handling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:49:0)
[22:42:04.483] Timer tick, asking Buildbucket for the build status
[22:42:04.568] Build 8864706521993636640: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:42:04.568] Scheduling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:50:0) after 1m0s
[22:43:04.611] Handling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:50:0)
[22:43:04.611] Timer tick, asking Buildbucket for the build status
[22:43:04.786] Build 8864706521993636640: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:43:04.786] Scheduling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:51:0) after 1m0s
[22:44:04.819] Handling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:51:0)
[22:44:04.819] Timer tick, asking Buildbucket for the build status
[22:44:05.027] Build 8864706521993636640: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:44:05.027] Scheduling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:52:0) after 1m0s
[22:45:05.048] Handling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:52:0)
[22:45:05.048] Timer tick, asking Buildbucket for the build status
[22:45:05.590] Build 8864706521993636640: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:45:05.590] Scheduling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:53:0) after 1m0s
[22:46:05.596] Handling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:53:0)
[22:46:05.596] Timer tick, asking Buildbucket for the build status
[22:46:05.665] Build 8864706521993636640: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:46:05.665] Scheduling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:54:0) after 1m0s
[22:47:05.689] Handling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:54:0)
[22:47:05.689] Timer tick, asking Buildbucket for the build status
[22:47:05.752] Build 8864706521993636640: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:47:05.752] Scheduling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:55:0) after 1m0s
[22:48:05.847] Handling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:55:0)
[22:48:05.847] Timer tick, asking Buildbucket for the build status
[22:48:05.911] Build 8864706521993636640: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:48:05.911] Scheduling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:56:0) after 1m0s
[22:49:05.935] Handling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:56:0)
[22:49:05.935] Timer tick, asking Buildbucket for the build status
[22:49:06.011] Build 8864706521993636640: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:49:06.011] Scheduling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:57:0) after 1m0s
[22:50:06.135] Handling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:57:0)
[22:50:06.135] Timer tick, asking Buildbucket for the build status
[22:50:06.308] Build 8864706521993636640: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:50:06.308] Scheduling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:58:0) after 1m0s
[22:51:06.406] Handling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:58:0)
[22:51:06.406] Timer tick, asking Buildbucket for the build status
[22:51:06.493] Build 8864706521993636640: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:51:06.493] Scheduling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:59:0) after 1m0s
[22:52:06.514] Handling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:59:0)
[22:52:06.514] Timer tick, asking Buildbucket for the build status
[22:52:06.598] Build 8864706521993636640: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:52:06.598] Scheduling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:60:0) after 1m0s
[22:53:06.918] Handling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:60:0)
[22:53:06.918] Timer tick, asking Buildbucket for the build status
[22:53:07.277] Build 8864706521993636640: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:53:07.277] Scheduling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:61:0) after 1m0s
[22:54:07.408] Handling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:61:0)
[22:54:07.408] Timer tick, asking Buildbucket for the build status
[22:54:07.487] Build 8864706521993636640: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:54:07.487] Scheduling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:62:0) after 1m0s
[22:55:07.563] Handling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:62:0)
[22:55:07.563] Timer tick, asking Buildbucket for the build status
[22:55:08.052] Build 8864706521993636640: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:55:08.052] Scheduling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:63:0) after 1m0s
[22:56:08.175] Handling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:63:0)
[22:56:08.175] Timer tick, asking Buildbucket for the build status
[22:56:08.345] Build 8864706521993636640: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:56:08.345] Scheduling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:64:0) after 1m0s
[22:57:08.450] Handling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:64:0)
[22:57:08.450] Timer tick, asking Buildbucket for the build status
[22:57:08.737] Build 8864706521993636640: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:57:08.737] Scheduling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:65:0) after 1m0s
[22:58:08.837] Handling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:65:0)
[22:58:08.837] Timer tick, asking Buildbucket for the build status
[22:58:08.923] Build 8864706521993636640: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:58:08.923] Scheduling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:66:0) after 1m0s
[22:59:09.028] Handling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:66:0)
[22:59:09.028] Timer tick, asking Buildbucket for the build status
[22:59:09.117] Build 8864706521993636640: status "STARTED", result "", failure_reason "", cancelation_reason ""
[22:59:09.117] Scheduling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:67:0) after 1m0s
[23:00:09.236] Handling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:67:0)
[23:00:09.236] Timer tick, asking Buildbucket for the build status
[23:00:09.824] Build 8864706521993636640: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:00:09.824] Scheduling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:68:0) after 1m0s
[23:01:09.954] Handling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:68:0)
[23:01:09.954] Timer tick, asking Buildbucket for the build status
[23:01:10.029] Build 8864706521993636640: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:01:10.029] Scheduling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:69:0) after 1m0s
[23:02:10.121] Handling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:69:0)
[23:02:10.121] Timer tick, asking Buildbucket for the build status
[23:02:10.195] Build 8864706521993636640: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:02:10.195] Scheduling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:70:0) after 1m0s
[23:03:10.222] Handling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:70:0)
[23:03:10.222] Timer tick, asking Buildbucket for the build status
[23:03:10.362] Build 8864706521993636640: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:03:10.362] Scheduling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:71:0) after 1m0s
[23:04:10.382] Handling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:71:0)
[23:04:10.382] Timer tick, asking Buildbucket for the build status
[23:04:10.703] Build 8864706521993636640: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:04:10.703] Scheduling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:72:0) after 1m0s
[23:05:10.716] Handling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:72:0)
[23:05:10.716] Timer tick, asking Buildbucket for the build status
[23:05:11.077] Build 8864706521993636640: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:05:11.077] Scheduling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:73:0) after 1m0s
[23:06:11.163] Handling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:73:0)
[23:06:11.163] Timer tick, asking Buildbucket for the build status
[23:06:11.243] Build 8864706521993636640: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:06:11.243] Scheduling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:74:0) after 1m0s
[23:07:11.256] Handling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:74:0)
[23:07:11.256] Timer tick, asking Buildbucket for the build status
[23:07:11.335] Build 8864706521993636640: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:07:11.335] Scheduling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:75:0) after 1m0s
[23:08:11.417] Handling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:75:0)
[23:08:11.417] Timer tick, asking Buildbucket for the build status
[23:08:11.863] Build 8864706521993636640: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:08:11.863] Scheduling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:76:0) after 1m0s
[23:09:11.888] Handling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:76:0)
[23:09:11.888] Timer tick, asking Buildbucket for the build status
[23:09:12.170] Build 8864706521993636640: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:09:12.170] Scheduling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:77:0) after 1m0s
[23:10:12.205] Handling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:77:0)
[23:10:12.205] Timer tick, asking Buildbucket for the build status
[23:10:12.465] Build 8864706521993636640: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:10:12.465] Scheduling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:78:0) after 1m0s
[23:11:12.550] Handling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:78:0)
[23:11:12.550] Timer tick, asking Buildbucket for the build status
[23:11:12.800] Build 8864706521993636640: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:11:12.800] Scheduling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:79:0) after 1m0s
[23:12:12.856] Handling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:79:0)
[23:12:12.856] Timer tick, asking Buildbucket for the build status
[23:12:12.927] Build 8864706521993636640: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:12:12.927] Scheduling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:80:0) after 1m0s
[23:13:12.954] Handling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:80:0)
[23:13:12.955] Timer tick, asking Buildbucket for the build status
[23:13:13.088] Build 8864706521993636640: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:13:13.088] Scheduling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:81:0) after 1m0s
[23:14:13.122] Handling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:81:0)
[23:14:13.122] Timer tick, asking Buildbucket for the build status
[23:14:13.196] Build 8864706521993636640: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:14:13.197] Scheduling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:82:0) after 1m0s
[23:15:13.282] Handling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:82:0)
[23:15:13.282] Timer tick, asking Buildbucket for the build status
[23:15:13.411] Build 8864706521993636640: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:15:13.411] Scheduling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:83:0) after 1m0s
[23:16:13.441] Handling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:83:0)
[23:16:13.441] Timer tick, asking Buildbucket for the build status
[23:16:13.554] Build 8864706521993636640: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:16:13.554] Scheduling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:84:0) after 1m0s
[23:17:13.738] Handling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:84:0)
[23:17:13.738] Timer tick, asking Buildbucket for the build status
[23:17:13.819] Build 8864706521993636640: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:17:13.819] Scheduling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:85:0) after 1m0s
[23:18:13.888] Handling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:85:0)
[23:18:13.888] Timer tick, asking Buildbucket for the build status
[23:18:14.125] Build 8864706521993636640: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:18:14.125] Scheduling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:86:0) after 1m0s
[23:19:14.177] Handling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:86:0)
[23:19:14.177] Timer tick, asking Buildbucket for the build status
[23:19:14.379] Build 8864706521993636640: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:19:14.379] Scheduling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:87:0) after 1m0s
[23:20:14.432] Handling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:87:0)
[23:20:14.432] Timer tick, asking Buildbucket for the build status
[23:20:14.586] Build 8864706521993636640: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:20:14.586] Scheduling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:88:0) after 1m0s
[23:21:14.604] Handling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:88:0)
[23:21:14.604] Timer tick, asking Buildbucket for the build status
[23:21:14.810] Build 8864706521993636640: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:21:14.810] Scheduling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:89:0) after 1m0s
[23:22:14.864] Handling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:89:0)
[23:22:14.864] Timer tick, asking Buildbucket for the build status
[23:22:14.958] Build 8864706521993636640: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:22:14.958] Scheduling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:90:0) after 1m0s
[23:23:15.428] Handling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:90:0)
[23:23:15.428] Timer tick, asking Buildbucket for the build status
[23:23:15.534] Build 8864706521993636640: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:23:15.534] Scheduling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:91:0) after 1m0s
[23:24:15.782] Handling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:91:0)
[23:24:15.782] Timer tick, asking Buildbucket for the build status
[23:24:15.875] Build 8864706521993636640: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:24:15.875] Scheduling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:92:0) after 1m0s
[23:25:16.118] Handling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:92:0)
[23:25:16.118] Timer tick, asking Buildbucket for the build status
[23:25:16.255] Build 8864706521993636640: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:25:16.256] Scheduling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:93:0) after 1m0s
[23:26:16.372] Handling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:93:0)
[23:26:16.372] Timer tick, asking Buildbucket for the build status
[23:26:16.483] Build 8864706521993636640: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:26:16.483] Scheduling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:94:0) after 1m0s
[23:27:16.637] Handling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:94:0)
[23:27:16.637] Timer tick, asking Buildbucket for the build status
[23:27:16.717] Build 8864706521993636640: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:27:16.717] Scheduling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:95:0) after 1m0s
[23:28:16.787] Handling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:95:0)
[23:28:16.787] Timer tick, asking Buildbucket for the build status
[23:28:16.875] Build 8864706521993636640: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:28:16.875] Scheduling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:96:0) after 1m0s
[23:29:17.096] Handling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:96:0)
[23:29:17.096] Timer tick, asking Buildbucket for the build status
[23:29:17.175] Build 8864706521993636640: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:29:17.175] Scheduling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:97:0) after 1m0s
[23:30:17.292] Handling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:97:0)
[23:30:17.292] Timer tick, asking Buildbucket for the build status
[23:30:17.832] Build 8864706521993636640: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:30:17.832] Scheduling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:98:0) after 1m0s
[23:31:17.872] Handling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:98:0)
[23:31:17.872] Timer tick, asking Buildbucket for the build status
[23:31:18.183] Build 8864706521993636640: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:31:18.183] Scheduling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:99:0) after 1m0s
[23:32:18.239] Handling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:99:0)
[23:32:18.239] Timer tick, asking Buildbucket for the build status
[23:32:18.512] Build 8864706521993636640: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:32:18.512] Scheduling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:100:0) after 1m0s
[23:33:18.540] Handling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:100:0)
[23:33:18.540] Timer tick, asking Buildbucket for the build status
[23:33:18.621] Build 8864706521993636640: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:33:18.621] Scheduling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:101:0) after 1m0s
[23:34:18.613] Handling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:101:0)
[23:34:18.613] Timer tick, asking Buildbucket for the build status
[23:34:18.683] Build 8864706521993636640: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:34:18.683] Scheduling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:102:0) after 1m0s
[23:35:18.705] Handling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:102:0)
[23:35:18.705] Timer tick, asking Buildbucket for the build status
[23:35:18.837] Build 8864706521993636640: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:35:18.837] Scheduling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:103:0) after 1m0s
[23:36:18.849] Handling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:103:0)
[23:36:18.849] Timer tick, asking Buildbucket for the build status
[23:36:18.937] Build 8864706521993636640: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:36:18.937] Scheduling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:104:0) after 1m0s
[23:37:19.021] Handling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:104:0)
[23:37:19.021] Timer tick, asking Buildbucket for the build status
[23:37:19.096] Build 8864706521993636640: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:37:19.096] Scheduling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:105:0) after 1m0s
[23:38:19.151] Handling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:105:0)
[23:38:19.151] Timer tick, asking Buildbucket for the build status
[23:38:19.222] Build 8864706521993636640: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:38:19.222] Scheduling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:106:0) after 1m0s
[23:39:19.277] Handling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:106:0)
[23:39:19.277] Timer tick, asking Buildbucket for the build status
[23:39:19.496] Build 8864706521993636640: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:39:19.496] Scheduling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:107:0) after 1m0s
[23:40:19.539] Handling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:107:0)
[23:40:19.539] Timer tick, asking Buildbucket for the build status
[23:40:20.112] Build 8864706521993636640: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:40:20.112] Scheduling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:108:0) after 1m0s
[23:41:20.193] Handling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:108:0)
[23:41:20.193] Timer tick, asking Buildbucket for the build status
[23:41:20.268] Build 8864706521993636640: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:41:20.268] Scheduling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:109:0) after 1m0s
[23:42:20.290] Handling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:109:0)
[23:42:20.290] Timer tick, asking Buildbucket for the build status
[23:42:20.379] Build 8864706521993636640: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:42:20.379] Scheduling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:110:0) after 1m0s
[23:43:20.452] Handling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:110:0)
[23:43:20.452] Timer tick, asking Buildbucket for the build status
[23:43:20.930] Build 8864706521993636640: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:43:20.931] Scheduling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:111:0) after 1m0s
[23:44:21.028] Handling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:111:0)
[23:44:21.028] Timer tick, asking Buildbucket for the build status
[23:44:21.115] Build 8864706521993636640: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:44:21.115] Scheduling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:112:0) after 1m0s
[23:45:21.166] Handling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:112:0)
[23:45:21.166] Timer tick, asking Buildbucket for the build status
[23:45:21.477] Build 8864706521993636640: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:45:21.477] Scheduling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:113:0) after 1m0s
[23:46:21.513] Handling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:113:0)
[23:46:21.513] Timer tick, asking Buildbucket for the build status
[23:46:21.598] Build 8864706521993636640: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:46:21.598] Scheduling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:114:0) after 1m0s
[23:47:21.657] Handling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:114:0)
[23:47:21.657] Timer tick, asking Buildbucket for the build status
[23:47:21.726] Build 8864706521993636640: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:47:21.726] Scheduling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:115:0) after 1m0s
[23:48:21.809] Handling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:115:0)
[23:48:21.809] Timer tick, asking Buildbucket for the build status
[23:48:22.078] Build 8864706521993636640: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:48:22.078] Scheduling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:116:0) after 1m0s
[23:49:22.062] Handling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:116:0)
[23:49:22.062] Timer tick, asking Buildbucket for the build status
[23:49:22.158] Build 8864706521993636640: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:49:22.158] Scheduling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:117:0) after 1m0s
[23:50:22.212] Handling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:117:0)
[23:50:22.212] Timer tick, asking Buildbucket for the build status
[23:50:22.336] Build 8864706521993636640: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:50:22.336] Scheduling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:118:0) after 1m0s
[23:51:22.365] Handling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:118:0)
[23:51:22.365] Timer tick, asking Buildbucket for the build status
[23:51:22.444] Build 8864706521993636640: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:51:22.444] Scheduling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:119:0) after 1m0s
[23:52:22.466] Handling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:119:0)
[23:52:22.466] Timer tick, asking Buildbucket for the build status
[23:52:22.589] Build 8864706521993636640: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:52:22.589] Scheduling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:120:0) after 1m0s
[23:53:22.595] Handling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:120:0)
[23:53:22.595] Timer tick, asking Buildbucket for the build status
[23:53:22.674] Build 8864706521993636640: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:53:22.674] Scheduling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:121:0) after 1m0s
[23:54:22.716] Handling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:121:0)
[23:54:22.716] Timer tick, asking Buildbucket for the build status
[23:54:22.788] Build 8864706521993636640: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:54:22.788] Scheduling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:122:0) after 1m0s
[23:55:22.868] Handling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:122:0)
[23:55:22.868] Timer tick, asking Buildbucket for the build status
[23:55:23.022] Build 8864706521993636640: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:55:23.022] Scheduling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:123:0) after 1m0s
[23:56:23.050] Handling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:123:0)
[23:56:23.050] Timer tick, asking Buildbucket for the build status
[23:56:23.130] Build 8864706521993636640: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:56:23.130] Scheduling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:124:0) after 1m0s
[23:57:23.159] Handling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:124:0)
[23:57:23.159] Timer tick, asking Buildbucket for the build status
[23:57:23.495] Build 8864706521993636640: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:57:23.495] Scheduling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:125:0) after 1m0s
[23:58:23.552] Handling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:125:0)
[23:58:23.552] Timer tick, asking Buildbucket for the build status
[23:58:23.635] Build 8864706521993636640: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:58:23.635] Scheduling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:126:0) after 1m0s
[23:59:23.703] Handling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:126:0)
[23:59:23.703] Timer tick, asking Buildbucket for the build status
[23:59:23.804] Build 8864706521993636640: status "STARTED", result "", failure_reason "", cancelation_reason ""
[23:59:23.804] Scheduling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:127:0) after 1m0s
[00:00:23.842] Handling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:127:0)
[00:00:23.842] Timer tick, asking Buildbucket for the build status
[00:00:23.980] Build 8864706521993636640: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:00:23.980] Scheduling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:128:0) after 1m0s
[00:01:24.014] Handling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:128:0)
[00:01:24.014] Timer tick, asking Buildbucket for the build status
[00:01:24.106] Build 8864706521993636640: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:01:24.106] Scheduling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:129:0) after 1m0s
[00:02:24.184] Handling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:129:0)
[00:02:24.184] Timer tick, asking Buildbucket for the build status
[00:02:24.243] Build 8864706521993636640: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:02:24.243] Scheduling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:130:0) after 1m0s
[00:03:24.281] Handling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:130:0)
[00:03:24.281] Timer tick, asking Buildbucket for the build status
[00:03:24.423] Build 8864706521993636640: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:03:24.423] Scheduling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:131:0) after 1m0s
[00:04:24.509] Handling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:131:0)
[00:04:24.509] Timer tick, asking Buildbucket for the build status
[00:04:24.623] Build 8864706521993636640: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:04:24.623] Scheduling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:132:0) after 1m0s
[00:05:24.829] Handling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:132:0)
[00:05:24.829] Timer tick, asking Buildbucket for the build status
[00:05:24.947] Build 8864706521993636640: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:05:24.947] Scheduling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:133:0) after 1m0s
[00:06:25.060] Handling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:133:0)
[00:06:25.060] Timer tick, asking Buildbucket for the build status
[00:06:25.132] Build 8864706521993636640: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:06:25.132] Scheduling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:134:0) after 1m0s
[00:07:25.157] Handling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:134:0)
[00:07:25.157] Timer tick, asking Buildbucket for the build status
[00:07:25.646] Build 8864706521993636640: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:07:25.646] Scheduling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:135:0) after 1m0s
[00:08:25.700] Handling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:135:0)
[00:08:25.700] Timer tick, asking Buildbucket for the build status
[00:08:25.775] Build 8864706521993636640: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:08:25.775] Scheduling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:136:0) after 1m0s
[00:09:26.067] Handling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:136:0)
[00:09:26.067] Timer tick, asking Buildbucket for the build status
[00:09:26.224] Build 8864706521993636640: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:09:26.224] Scheduling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:137:0) after 1m0s
[00:10:26.243] Handling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:137:0)
[00:10:26.243] Timer tick, asking Buildbucket for the build status
[00:10:26.365] Build 8864706521993636640: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:10:26.365] Scheduling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:138:0) after 1m0s
[00:11:26.438] Handling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:138:0)
[00:11:26.438] Timer tick, asking Buildbucket for the build status
[00:11:26.505] Build 8864706521993636640: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:11:26.505] Scheduling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:139:0) after 1m0s
[00:12:26.579] Handling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:139:0)
[00:12:26.579] Timer tick, asking Buildbucket for the build status
[00:12:26.650] Build 8864706521993636640: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:12:26.650] Scheduling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:140:0) after 1m0s
[00:13:26.758] Handling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:140:0)
[00:13:26.758] Timer tick, asking Buildbucket for the build status
[00:13:27.400] Build 8864706521993636640: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:13:27.400] Scheduling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:141:0) after 1m0s
[00:14:27.449] Handling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:141:0)
[00:14:27.449] Timer tick, asking Buildbucket for the build status
[00:14:27.618] Build 8864706521993636640: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:14:27.618] Scheduling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:142:0) after 1m0s
[00:15:27.738] Handling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:142:0)
[00:15:27.738] Timer tick, asking Buildbucket for the build status
[00:15:27.927] Build 8864706521993636640: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:15:27.927] Scheduling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:143:0) after 1m0s
[00:16:27.980] Handling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:143:0)
[00:16:27.980] Timer tick, asking Buildbucket for the build status
[00:16:28.053] Build 8864706521993636640: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:16:28.053] Scheduling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:144:0) after 1m0s
[00:17:28.031] Handling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:144:0)
[00:17:28.031] Timer tick, asking Buildbucket for the build status
[00:17:28.122] Build 8864706521993636640: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:17:28.122] Scheduling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:145:0) after 1m0s
[00:18:28.229] Handling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:145:0)
[00:18:28.229] Timer tick, asking Buildbucket for the build status
[00:18:28.334] Build 8864706521993636640: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:18:28.334] Scheduling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:146:0) after 1m0s
[00:19:28.499] Handling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:146:0)
[00:19:28.499] Timer tick, asking Buildbucket for the build status
[00:19:28.662] Build 8864706521993636640: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:19:28.662] Scheduling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:147:0) after 1m0s
[00:20:28.773] Handling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:147:0)
[00:20:28.773] Timer tick, asking Buildbucket for the build status
[00:20:29.094] Build 8864706521993636640: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:20:29.094] Scheduling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:148:0) after 1m0s
[00:21:29.170] Handling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:148:0)
[00:21:29.170] Timer tick, asking Buildbucket for the build status
[00:21:29.245] Build 8864706521993636640: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:21:29.245] Scheduling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:149:0) after 1m0s
[00:22:29.268] Handling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:149:0)
[00:22:29.268] Timer tick, asking Buildbucket for the build status
[00:22:29.347] Build 8864706521993636640: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:22:29.347] Scheduling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:150:0) after 1m0s
[00:23:29.346] Handling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:150:0)
[00:23:29.346] Timer tick, asking Buildbucket for the build status
[00:23:29.425] Build 8864706521993636640: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:23:29.425] Scheduling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:151:0) after 1m0s
[00:24:29.494] Handling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:151:0)
[00:24:29.494] Timer tick, asking Buildbucket for the build status
[00:24:29.568] Build 8864706521993636640: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:24:29.568] Scheduling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:152:0) after 1m0s
[00:25:29.628] Handling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:152:0)
[00:25:29.628] Timer tick, asking Buildbucket for the build status
[00:25:29.822] Build 8864706521993636640: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:25:29.822] Scheduling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:153:0) after 1m0s
[00:26:29.898] Handling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:153:0)
[00:26:29.898] Timer tick, asking Buildbucket for the build status
[00:26:30.037] Build 8864706521993636640: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:26:30.037] Scheduling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:154:0) after 1m0s
[00:27:30.097] Handling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:154:0)
[00:27:30.097] Timer tick, asking Buildbucket for the build status
[00:27:30.176] Build 8864706521993636640: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:27:30.176] Scheduling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:155:0) after 1m0s
[00:28:30.204] Handling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:155:0)
[00:28:30.204] Timer tick, asking Buildbucket for the build status
[00:28:32.378] Build 8864706521993636640: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:28:32.378] Scheduling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:156:0) after 1m0s
[00:29:32.360] Handling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:156:0)
[00:29:32.360] Timer tick, asking Buildbucket for the build status
[00:29:32.428] Build 8864706521993636640: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:29:32.428] Scheduling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:157:0) after 1m0s
[00:30:32.594] Handling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:157:0)
[00:30:32.594] Timer tick, asking Buildbucket for the build status
[00:30:32.716] Build 8864706521993636640: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:30:32.716] Scheduling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:158:0) after 1m0s
[00:31:32.799] Handling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:158:0)
[00:31:32.799] Timer tick, asking Buildbucket for the build status
[00:31:32.901] Build 8864706521993636640: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:31:32.901] Scheduling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:159:0) after 1m0s
[00:32:32.938] Handling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:159:0)
[00:32:32.938] Timer tick, asking Buildbucket for the build status
[00:32:33.018] Build 8864706521993636640: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:32:33.018] Scheduling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:160:0) after 1m0s
[00:33:33.123] Handling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:160:0)
[00:33:33.123] Timer tick, asking Buildbucket for the build status
[00:33:33.297] Build 8864706521993636640: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:33:33.297] Scheduling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:161:0) after 1m0s
[00:34:33.428] Handling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:161:0)
[00:34:33.428] Timer tick, asking Buildbucket for the build status
[00:34:33.871] Build 8864706521993636640: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:34:33.871] Scheduling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:162:0) after 1m0s
[00:35:33.970] Handling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:162:0)
[00:35:33.970] Timer tick, asking Buildbucket for the build status
[00:35:34.108] Build 8864706521993636640: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:35:34.108] Scheduling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:163:0) after 1m0s
[00:36:34.314] Handling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:163:0)
[00:36:34.314] Timer tick, asking Buildbucket for the build status
[00:36:34.527] Build 8864706521993636640: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:36:34.527] Scheduling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:164:0) after 1m0s
[00:37:34.647] Handling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:164:0)
[00:37:34.647] Timer tick, asking Buildbucket for the build status
[00:37:34.730] Build 8864706521993636640: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:37:34.730] Scheduling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:165:0) after 1m0s
[00:38:34.883] Handling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:165:0)
[00:38:34.883] Timer tick, asking Buildbucket for the build status
[00:38:34.953] Build 8864706521993636640: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:38:34.953] Scheduling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:166:0) after 1m0s
[00:39:35.083] Handling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:166:0)
[00:39:35.083] Timer tick, asking Buildbucket for the build status
[00:39:35.545] Build 8864706521993636640: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:39:35.545] Scheduling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:167:0) after 1m0s
[00:40:35.563] Handling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:167:0)
[00:40:35.563] Timer tick, asking Buildbucket for the build status
[00:40:35.798] Build 8864706521993636640: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:40:35.798] Scheduling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:168:0) after 1m0s
[00:41:35.857] Handling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:168:0)
[00:41:35.857] Timer tick, asking Buildbucket for the build status
[00:41:35.927] Build 8864706521993636640: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:41:35.927] Scheduling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:169:0) after 1m0s
[00:42:35.989] Handling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:169:0)
[00:42:35.989] Timer tick, asking Buildbucket for the build status
[00:42:36.072] Build 8864706521993636640: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:42:36.072] Scheduling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:170:0) after 1m0s
[00:43:36.132] Handling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:170:0)
[00:43:36.132] Timer tick, asking Buildbucket for the build status
[00:43:36.224] Build 8864706521993636640: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:43:36.224] Scheduling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:171:0) after 1m0s
[00:44:36.333] Handling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:171:0)
[00:44:36.333] Timer tick, asking Buildbucket for the build status
[00:44:36.401] Build 8864706521993636640: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:44:36.401] Scheduling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:172:0) after 1m0s
[00:45:36.423] Handling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:172:0)
[00:45:36.423] Timer tick, asking Buildbucket for the build status
[00:45:36.574] Build 8864706521993636640: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:45:36.574] Scheduling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:173:0) after 1m0s
[00:46:36.624] Handling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:173:0)
[00:46:36.624] Timer tick, asking Buildbucket for the build status
[00:46:36.989] Build 8864706521993636640: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:46:36.989] Scheduling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:174:0) after 1m0s
[00:47:37.122] Handling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:174:0)
[00:47:37.122] Timer tick, asking Buildbucket for the build status
[00:47:37.371] Build 8864706521993636640: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:47:37.371] Scheduling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:175:0) after 1m0s
[00:48:37.526] Handling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:175:0)
[00:48:37.526] Timer tick, asking Buildbucket for the build status
[00:48:37.698] Build 8864706521993636640: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:48:37.698] Scheduling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:176:0) after 1m0s
[00:49:37.715] Handling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:176:0)
[00:49:37.715] Timer tick, asking Buildbucket for the build status
[00:49:37.795] Build 8864706521993636640: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:49:37.795] Scheduling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:177:0) after 1m0s
[00:50:37.885] Handling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:177:0)
[00:50:37.885] Timer tick, asking Buildbucket for the build status
[00:50:38.007] Build 8864706521993636640: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:50:38.007] Scheduling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:178:0) after 1m0s
[00:51:38.122] Handling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:178:0)
[00:51:38.122] Timer tick, asking Buildbucket for the build status
[00:51:38.207] Build 8864706521993636640: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:51:38.207] Scheduling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:179:0) after 1m0s
[00:52:38.327] Handling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:179:0)
[00:52:38.327] Timer tick, asking Buildbucket for the build status
[00:52:38.403] Build 8864706521993636640: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:52:38.403] Scheduling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:180:0) after 1m0s
[00:53:38.439] Handling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:180:0)
[00:53:38.439] Timer tick, asking Buildbucket for the build status
[00:53:38.578] Build 8864706521993636640: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:53:38.578] Scheduling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:181:0) after 1m0s
[00:54:38.573] Handling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:181:0)
[00:54:38.573] Timer tick, asking Buildbucket for the build status
[00:54:38.649] Build 8864706521993636640: status "STARTED", result "", failure_reason "", cancelation_reason ""
[00:54:38.649] Scheduling timer "check-buildbucket-build-status" (dart/gclient:9030136584103782112:182:0) after 1m0s
[00:55:33.318] Received PubSub notification, asking Buildbucket for the build status
[00:55:33.392] Build 8864706521993636640: status "COMPLETED", result "FAILURE", failure_reason "INFRA_FAILURE", cancelation_reason ""
[00:55:33.392] Buildbucket build:
{
"build": {
"bucket": "luci.dart.ci.sandbox",
"canary_preference": "PROD",
"completed_ts": "1604364932365154",
"created_by": "project:dart",
"created_ts": "1604354089703806",
"failure_reason": "INFRA_FAILURE",
"id": "8864706521993636640",
"parameters_json": "{\"builder_name\": \"gclient\", \"properties\": {\"$recipe_engine/scheduler\": {\"hostname\": \"luci-scheduler.appspot.com\", \"triggers\": [{\"gitiles\": {\"ref\": \"refs/heads/master\", \"repo\": \"https://dart.googlesource.com/sdk\", \"revision\": \"ab7dc265d780f5fd018f06860f270d54a4536f01\"}, \"id\": \"https://dart.googlesource.com/sdk/+/refs/heads/master@ab7dc265d780f5fd018f06860f270d54a4536f01\", \"title\": \"ab7dc265d780f5fd018f06860f270d54a4536f01\", \"url\": \"https://dart.googlesource.com/sdk/+/ab7dc265d780f5fd018f06860f270d54a4536f01\"}, {\"gitiles\": {\"ref\": \"refs/heads/master\", \"repo\": \"https://dart.googlesource.com/sdk\", \"revision\": \"47b5a1e9f533da24579752fe6af910a58ef4f5d8\"}, \"id\": \"https://dart.googlesource.com/sdk/+/refs/heads/master@47b5a1e9f533da24579752fe6af910a58ef4f5d8\", \"title\": \"47b5a1e9f533da24579752fe6af910a58ef4f5d8\", \"url\": \"https://dart.googlesource.com/sdk/+/47b5a1e9f533da24579752fe6af910a58ef4f5d8\"}]}, \"branch\": \"refs/heads/master\", \"repository\": \"https://dart.googlesource.com/sdk\", \"revision\": \"47b5a1e9f533da24579752fe6af910a58ef4f5d8\"}}",
"project": "dart",
"result": "FAILURE",
"result_details_json": "{\"error\": {\"message\": \"recipe infra failure: Recipe timed out\"}, \"properties\": {\"$build/goma\": {\"enable_ats\": true, \"server_host\": \"goma.chromium.org\", \"use_luci_auth\": true}, \"$recipe_engine/isolated\": {\"server\": \"https://isolateserver.appspot.com\"}, \"$recipe_engine/path\": {\"cache_dir\": \"/b/s/w/ir/cache\", \"temp_dir\": \"/b/s/w/ir/tmp/rt\"}, \"$recipe_engine/runtime\": {\"is_experimental\": false, \"is_luci\": true}, \"$recipe_engine/scheduler\": {\"hostname\": \"luci-scheduler.appspot.com\", \"triggers\": [{\"gitiles\": {\"ref\": \"refs/heads/master\", \"repo\": \"https://dart.googlesource.com/sdk\", \"revision\": \"ab7dc265d780f5fd018f06860f270d54a4536f01\"}, \"id\": \"https://dart.googlesource.com/sdk/+/refs/heads/master@ab7dc265d780f5fd018f06860f270d54a4536f01\", \"title\": \"ab7dc265d780f5fd018f06860f270d54a4536f01\", \"url\": \"https://dart.googlesource.com/sdk/+/ab7dc265d780f5fd018f06860f270d54a4536f01\"}, {\"gitiles\": {\"ref\": \"refs/heads/master\", \"repo\": \"https://dart.googlesource.com/sdk\", \"revision\": \"47b5a1e9f533da24579752fe6af910a58ef4f5d8\"}, \"id\": \"https://dart.googlesource.com/sdk/+/refs/heads/master@47b5a1e9f533da24579752fe6af910a58ef4f5d8\", \"title\": \"47b5a1e9f533da24579752fe6af910a58ef4f5d8\", \"url\": \"https://dart.googlesource.com/sdk/+/47b5a1e9f533da24579752fe6af910a58ef4f5d8\"}]}, \"$recipe_engine/swarming\": {\"server\": \"https://chromium-swarm.appspot.com\"}, \"bot_id\": \"luci-dart-try-xenial-13-iv4o\", \"branch\": \"refs/heads/master\", \"buildername\": \"gclient\", \"buildnumber\": 10567, \"clobber\": \"true\", \"path_config\": \"generic\", \"recipe\": \"dart/gclient\", \"repository\": \"https://dart.googlesource.com/sdk\", \"revision\": \"47b5a1e9f533da24579752fe6af910a58ef4f5d8\"}, \"swarming\": {\"bot_dimensions\": {\"caches\": [\"browsers\", \"builder_3d4f0d2f99912213642a836ae9100fafdf334be97356eec3542a1d8dd9a5eac5_v2\", \"builder_45158029e60e917c702b014e7c5c6ca7d16c3aca639215f7d09b76625cd2646a_v2\", \"builder_51b593ded8badb9f1a3c8ac8207abb3ced1333a97ea732bca9bc14b93e1e73ed_v2\", \"builder_5cff9110469e28e8e57e5372be456181cbf25026f557924d52b0be822ceaf1eb_v2\", \"builder_7ab5b27085f3863c581f6875593cfe86e607483675b08f5642ba898f61ebb33d_v2\", \"builder_7c3609552306ff7d5ad4bfd63effb4ceea2e1a541618e71c97ae514f24ede29b_v2\", \"builder_7ca4e700e3655ef1ac064f7657b0d64f701cf175fcd208776bdb6c436d9e8cda_v2\", \"builder_a59720d01483dc0eab644c075d75fd3380c8524472830ecbda587aed32776a52_v2\", \"builder_d12c26ea02592d766fa897b3a9f1968750a07bd9a90f9cf17f0bdf313cb29dcb_v2\", \"builder_d45c797facb38341f63d58a74300d26a2d949dc45b64fdd84f82fd2cf23ea611_v2\", \"builder_de2f45c670c5ef61720bbf05943b0d093fc36ab9b4db0bfbb3fe1513b6318dfd_v2\", \"git\", \"goma_v2\", \"vpython\"], \"cores\": [\"8\"], \"cpu\": [\"x86\", \"x86-64\", \"x86-64-Haswell_GCE\", \"x86-64-avx2\"], \"gce\": [\"1\"], \"gcp\": [\"dart-ci\"], \"gpu\": [\"none\"], \"host_class\": [\"default\"], \"id\": [\"luci-dart-try-xenial-13-iv4o\"], \"image\": [\"dart-xenial-20101000-265b45aa9e2\"], \"inside_docker\": [\"0\"], \"kvm\": [\"1\"], \"locale\": [\"en_US.UTF-8\"], \"machine_type\": [\"e2-standard-8\"], \"os\": [\"Linux\", \"Ubuntu\", \"Ubuntu-16\", \"Ubuntu-16.04\", \"Ubuntu-16.04.6\"], \"pool\": [\"dart.tests\", \"luci.dart.try\"], \"python\": [\"2.7.12\"], \"server_version\": [\"5614-d862eaa\"], \"ssd\": [\"0\"], \"zone\": [\"us\", \"us-central\", \"us-central1\", \"us-central1-b\"]}}, \"ui\": {\"info\": \"recipe infra failure: Recipe timed out\"}}",
"service_account": "dart-luci-try-builder@dart-ci.iam.gserviceaccount.com",
"started_ts": "1604354128035814",
"status": "COMPLETED",
"status_changed_ts": "1604354131261796",
"tags": [
"build_address:luci.dart.ci.sandbox/gclient/10567",
"builder:gclient",
"buildset:commit/git/47b5a1e9f533da24579752fe6af910a58ef4f5d8",
"buildset:commit/gitiles/dart.googlesource.com/sdk/+/47b5a1e9f533da24579752fe6af910a58ef4f5d8",
"gitiles_ref:refs/heads/master",
"scheduler_invocation_id:9030136584103782112",
"scheduler_job_id:dart/gclient",
"swarming_hostname:chromium-swarm.appspot.com",
"swarming_tag:log_location:logdog://logs.chromium.org/dart/buildbucket/cr-buildbucket.appspot.com/8864706521993636640/+/annotations",
"swarming_tag:luci_project:dart",
"swarming_tag:os:Linux",
"swarming_tag:recipe_name:dart/gclient",
"swarming_tag:recipe_package:dart/recipe_bundles/dart.googlesource.com/recipes",
"swarming_task_id:4fa3c62eeb113110",
"user_agent:luci-scheduler"
],
"updated_ts": "1604364932854703",
"url": "https://ci.chromium.org/b/8864706521993636640",
"utcnow_ts": "1604364933384140"
}
}
[00:55:33.392] Invocation finished in 3h0m45.085594604s with status FAILED