[09:46:08.266] New invocation is queued and will start shortly
[09:46:08.266] Triggered by user:v8-ci-builder@chops-service-accounts.iam.gserviceaccount.com
[09:46:09.646] Starting the invocation (attempt 1)
[09:46:09.685] Preparing PubSub topic for "https://cr-buildbucket.appspot.com"
[09:46:09.685] PubSub topic is "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
[09:46:09.685] Buildbucket request:
{
"bucket": "luci.v8.ci",
"client_operation_id": "9098583137539880064",
"parameters_json": "{\"builder_name\":\"V8 NumFuzz - debug\",\"properties\":{\"parent_build_config\":\"Debug\",\"parent_build_environment\":{\"gn_args\":\"is_component_build = true is_debug = true target_cpu = \\\"x64\\\" use_goma = true v8_enable_backtrace = true v8_enable_slow_dchecks = true\"},\"parent_buildername\":\"V8 Clusterfuzz Linux64 - debug builder\",\"parent_got_revision\":\"d46467c0d2a7fc9285ebf6f20ad0a7f1b24a73bd\",\"parent_got_revision_cp\":\"refs/heads/master@{#56468}\",\"parent_got_swarming_client_revision\":\"486c9b53c4d54dd4b95bb6ce0e31160e600dfc11\",\"revision\":\"d46467c0d2a7fc9285ebf6f20ad0a7f1b24a73bd\",\"swarm_hashes\":{\"d8_default\":\"54326b2550f6992d5e97754de289ea3ac2d48078\",\"run-num-fuzzer\":\"33a8f33ad19eb6a1deb1eba69bd4791ee2a18050\"}}}",
"pubsub_callback": {
"auth_token": "...",
"topic": "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
},
"tags": [
"builder:V8 NumFuzz - debug",
"scheduler_invocation_id:9098583137539880064",
"scheduler_job_id:v8/V8 NumFuzz - debug",
"user_agent:luci-scheduler",
"buildset:commit/gitiles/chromium.googlesource.com/v8/v8/+/d46467c0d2a7fc9285ebf6f20ad0a7f1b24a73bd",
"gitiles_ref:refs/heads/master",
"parent_buildername:V8 Clusterfuzz Linux64 - debug builder",
"parent_buildnumber:3845",
"user_agent:recipe"
]
}
[09:46:10.555] Buildbucket response:
{
"build": {
"bucket": "luci.v8.ci",
"canary": true,
"canary_preference": "AUTO",
"created_by": "user:luci-scheduler@appspot.gserviceaccount.com",
"created_ts": "1539078369762676",
"id": "8933153075306788992",
"lease_expiration_ts": "1539206170257791",
"lease_key": "1465886795",
"parameters_json": "{\"builder_name\": \"V8 NumFuzz - debug\", \"properties\": {\"parent_build_config\": \"Debug\", \"parent_build_environment\": {\"gn_args\": \"is_component_build = true is_debug = true target_cpu = \\\"x64\\\" use_goma = true v8_enable_backtrace = true v8_enable_slow_dchecks = true\"}, \"parent_buildername\": \"V8 Clusterfuzz Linux64 - debug builder\", \"parent_got_revision\": \"d46467c0d2a7fc9285ebf6f20ad0a7f1b24a73bd\", \"parent_got_revision_cp\": \"refs/heads/master@{#56468}\", \"parent_got_swarming_client_revision\": \"486c9b53c4d54dd4b95bb6ce0e31160e600dfc11\", \"revision\": \"d46467c0d2a7fc9285ebf6f20ad0a7f1b24a73bd\", \"swarm_hashes\": {\"d8_default\": \"54326b2550f6992d5e97754de289ea3ac2d48078\", \"run-num-fuzzer\": \"33a8f33ad19eb6a1deb1eba69bd4791ee2a18050\"}}}",
"project": "v8",
"result_details_json": "null",
"service_account": "v8-ci-builder@chops-service-accounts.iam.gserviceaccount.com",
"status": "SCHEDULED",
"status_changed_ts": "1539078370465403",
"tags": [
"build_address:luci.v8.ci/V8 NumFuzz - debug/3172",
"builder:V8 NumFuzz - debug",
"buildset:commit/gitiles/chromium.googlesource.com/v8/v8/+/d46467c0d2a7fc9285ebf6f20ad0a7f1b24a73bd",
"gitiles_ref:refs/heads/master",
"parent_buildername:V8 Clusterfuzz Linux64 - debug builder",
"parent_buildnumber:3845",
"scheduler_invocation_id:9098583137539880064",
"scheduler_job_id:v8/V8 NumFuzz - debug",
"swarming_dimension:host_class:multibot",
"swarming_dimension:pool:luci.v8.ci",
"swarming_hostname:chromium-swarm.appspot.com",
"swarming_tag:build_address:luci.v8.ci/V8 NumFuzz - debug/3172",
"swarming_tag:buildbucket_bucket:luci.v8.ci",
"swarming_tag:buildbucket_build_id:8933153075306788992",
"swarming_tag:buildbucket_hostname:cr-buildbucket.appspot.com",
"swarming_tag:buildbucket_template_canary:1",
"swarming_tag:buildbucket_template_revision:4c790cbde9342069ed9b59b6709c8807b14f2913",
"swarming_tag:builder:V8 NumFuzz - debug",
"swarming_tag:buildset:commit/gitiles/chromium.googlesource.com/v8/v8/+/d46467c0d2a7fc9285ebf6f20ad0a7f1b24a73bd",
"swarming_tag:gitiles_ref:refs/heads/master",
"swarming_tag:host_class:multibot",
"swarming_tag:log_location:logdog://logs.chromium.org/v8/buildbucket/cr-buildbucket.appspot.com/8933153075306788992/+/annotations",
"swarming_tag:luci_project:v8",
"swarming_tag:parent_buildername:V8 Clusterfuzz Linux64 - debug builder",
"swarming_tag:parent_buildnumber:3845",
"swarming_tag:pool:luci.v8.ci",
"swarming_tag:priority:30",
"swarming_tag:recipe_name:v8",
"swarming_tag:recipe_package:infra/recipe_bundles/chromium.googlesource.com/chromium/tools/build",
"swarming_tag:scheduler_invocation_id:9098583137539880064",
"swarming_tag:scheduler_job_id:v8/V8 NumFuzz - debug",
"swarming_tag:service_account:v8-ci-builder@chops-service-accounts.iam.gserviceaccount.com",
"swarming_tag:swarming.pool.template:skip",
"swarming_tag:swarming.pool.version:02bdf727c78e311c1f6a89f60a30eee8127f12a8",
"swarming_tag:user:None",
"swarming_tag:user_agent:luci-scheduler",
"swarming_tag:user_agent:recipe",
"swarming_tag:vpython:native-python-wrapper",
"swarming_task_id:407109bb2290ac10",
"user_agent:luci-scheduler",
"user_agent:recipe"
],
"updated_ts": "1539078370465498",
"url": "https://ci.chromium.org/p/v8/builders/luci.v8.ci/V8 NumFuzz - debug/3172",
"utcnow_ts": "1539078370543952"
}
}
[09:46:10.555] Task URL: https://ci.chromium.org/p/v8/builders/luci.v8.ci/V8 NumFuzz - debug/3172
[09:46:10.555] Scheduling timer "check-buildbucket-build-status" (v8/V8 NumFuzz - debug:9098583137539880064:2:0) after 1m0s
[09:46:11.656] Received PubSub notification, asking Buildbucket for the build status
[09:46:12.000] Build 8933153075306788992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:47:10.577] Handling timer "check-buildbucket-build-status" (v8/V8 NumFuzz - debug:9098583137539880064:2:0)
[09:47:10.577] Timer tick, asking Buildbucket for the build status
[09:47:10.642] Build 8933153075306788992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:47:10.642] Scheduling timer "check-buildbucket-build-status" (v8/V8 NumFuzz - debug:9098583137539880064:4:0) after 1m0s
[09:48:10.747] Handling timer "check-buildbucket-build-status" (v8/V8 NumFuzz - debug:9098583137539880064:4:0)
[09:48:10.747] Timer tick, asking Buildbucket for the build status
[09:48:10.806] Build 8933153075306788992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:48:10.806] Scheduling timer "check-buildbucket-build-status" (v8/V8 NumFuzz - debug:9098583137539880064:5:0) after 1m0s
[09:49:10.956] Handling timer "check-buildbucket-build-status" (v8/V8 NumFuzz - debug:9098583137539880064:5:0)
[09:49:10.957] Timer tick, asking Buildbucket for the build status
[09:49:10.996] Build 8933153075306788992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:49:10.996] Scheduling timer "check-buildbucket-build-status" (v8/V8 NumFuzz - debug:9098583137539880064:6:0) after 1m0s
[09:50:11.128] Handling timer "check-buildbucket-build-status" (v8/V8 NumFuzz - debug:9098583137539880064:6:0)
[09:50:11.128] Timer tick, asking Buildbucket for the build status
[09:50:11.189] Build 8933153075306788992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:50:11.189] Scheduling timer "check-buildbucket-build-status" (v8/V8 NumFuzz - debug:9098583137539880064:7:0) after 1m0s
[09:51:11.210] Handling timer "check-buildbucket-build-status" (v8/V8 NumFuzz - debug:9098583137539880064:7:0)
[09:51:11.210] Timer tick, asking Buildbucket for the build status
[09:51:11.295] Build 8933153075306788992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:51:11.295] Scheduling timer "check-buildbucket-build-status" (v8/V8 NumFuzz - debug:9098583137539880064:8:0) after 1m0s
[09:52:11.345] Handling timer "check-buildbucket-build-status" (v8/V8 NumFuzz - debug:9098583137539880064:8:0)
[09:52:11.345] Timer tick, asking Buildbucket for the build status
[09:52:11.390] Build 8933153075306788992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:52:11.390] Scheduling timer "check-buildbucket-build-status" (v8/V8 NumFuzz - debug:9098583137539880064:9:0) after 1m0s
[09:53:11.408] Handling timer "check-buildbucket-build-status" (v8/V8 NumFuzz - debug:9098583137539880064:9:0)
[09:53:11.408] Timer tick, asking Buildbucket for the build status
[09:53:11.475] Build 8933153075306788992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:53:11.475] Scheduling timer "check-buildbucket-build-status" (v8/V8 NumFuzz - debug:9098583137539880064:10:0) after 1m0s
[09:54:11.590] Handling timer "check-buildbucket-build-status" (v8/V8 NumFuzz - debug:9098583137539880064:10:0)
[09:54:11.590] Timer tick, asking Buildbucket for the build status
[09:54:11.642] Build 8933153075306788992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:54:11.642] Scheduling timer "check-buildbucket-build-status" (v8/V8 NumFuzz - debug:9098583137539880064:11:0) after 1m0s
[09:55:11.736] Handling timer "check-buildbucket-build-status" (v8/V8 NumFuzz - debug:9098583137539880064:11:0)
[09:55:11.736] Timer tick, asking Buildbucket for the build status
[09:55:11.835] Build 8933153075306788992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:55:11.835] Scheduling timer "check-buildbucket-build-status" (v8/V8 NumFuzz - debug:9098583137539880064:12:0) after 1m0s
[09:56:11.953] Handling timer "check-buildbucket-build-status" (v8/V8 NumFuzz - debug:9098583137539880064:12:0)
[09:56:11.953] Timer tick, asking Buildbucket for the build status
[09:56:12.126] Build 8933153075306788992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:56:12.126] Scheduling timer "check-buildbucket-build-status" (v8/V8 NumFuzz - debug:9098583137539880064:13:0) after 1m0s
[09:57:12.159] Handling timer "check-buildbucket-build-status" (v8/V8 NumFuzz - debug:9098583137539880064:13:0)
[09:57:12.159] Timer tick, asking Buildbucket for the build status
[09:57:12.367] Build 8933153075306788992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:57:12.367] Scheduling timer "check-buildbucket-build-status" (v8/V8 NumFuzz - debug:9098583137539880064:14:0) after 1m0s
[09:58:12.389] Handling timer "check-buildbucket-build-status" (v8/V8 NumFuzz - debug:9098583137539880064:14:0)
[09:58:12.389] Timer tick, asking Buildbucket for the build status
[09:58:12.481] Build 8933153075306788992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:58:12.481] Scheduling timer "check-buildbucket-build-status" (v8/V8 NumFuzz - debug:9098583137539880064:15:0) after 1m0s
[09:59:12.564] Handling timer "check-buildbucket-build-status" (v8/V8 NumFuzz - debug:9098583137539880064:15:0)
[09:59:12.564] Timer tick, asking Buildbucket for the build status
[09:59:12.610] Build 8933153075306788992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[09:59:12.611] Scheduling timer "check-buildbucket-build-status" (v8/V8 NumFuzz - debug:9098583137539880064:16:0) after 1m0s
[10:00:12.661] Handling timer "check-buildbucket-build-status" (v8/V8 NumFuzz - debug:9098583137539880064:16:0)
[10:00:12.661] Timer tick, asking Buildbucket for the build status
[10:00:12.740] Build 8933153075306788992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:00:12.740] Scheduling timer "check-buildbucket-build-status" (v8/V8 NumFuzz - debug:9098583137539880064:17:0) after 1m0s
[10:01:12.758] Handling timer "check-buildbucket-build-status" (v8/V8 NumFuzz - debug:9098583137539880064:17:0)
[10:01:12.758] Timer tick, asking Buildbucket for the build status
[10:01:12.846] Build 8933153075306788992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:01:12.846] Scheduling timer "check-buildbucket-build-status" (v8/V8 NumFuzz - debug:9098583137539880064:18:0) after 1m0s
[10:02:12.866] Handling timer "check-buildbucket-build-status" (v8/V8 NumFuzz - debug:9098583137539880064:18:0)
[10:02:12.866] Timer tick, asking Buildbucket for the build status
[10:02:12.936] Build 8933153075306788992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:02:12.936] Scheduling timer "check-buildbucket-build-status" (v8/V8 NumFuzz - debug:9098583137539880064:19:0) after 1m0s
[10:03:13.048] Handling timer "check-buildbucket-build-status" (v8/V8 NumFuzz - debug:9098583137539880064:19:0)
[10:03:13.049] Timer tick, asking Buildbucket for the build status
[10:03:13.114] Build 8933153075306788992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:03:13.114] Scheduling timer "check-buildbucket-build-status" (v8/V8 NumFuzz - debug:9098583137539880064:20:0) after 1m0s
[10:04:13.136] Handling timer "check-buildbucket-build-status" (v8/V8 NumFuzz - debug:9098583137539880064:20:0)
[10:04:13.136] Timer tick, asking Buildbucket for the build status
[10:04:13.202] Build 8933153075306788992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:04:13.202] Scheduling timer "check-buildbucket-build-status" (v8/V8 NumFuzz - debug:9098583137539880064:21:0) after 1m0s
[10:05:13.219] Handling timer "check-buildbucket-build-status" (v8/V8 NumFuzz - debug:9098583137539880064:21:0)
[10:05:13.220] Timer tick, asking Buildbucket for the build status
[10:05:13.298] Build 8933153075306788992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:05:13.298] Scheduling timer "check-buildbucket-build-status" (v8/V8 NumFuzz - debug:9098583137539880064:22:0) after 1m0s
[10:06:13.346] Handling timer "check-buildbucket-build-status" (v8/V8 NumFuzz - debug:9098583137539880064:22:0)
[10:06:13.346] Timer tick, asking Buildbucket for the build status
[10:06:13.459] Build 8933153075306788992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:06:13.459] Scheduling timer "check-buildbucket-build-status" (v8/V8 NumFuzz - debug:9098583137539880064:23:0) after 1m0s
[10:07:13.477] Handling timer "check-buildbucket-build-status" (v8/V8 NumFuzz - debug:9098583137539880064:23:0)
[10:07:13.477] Timer tick, asking Buildbucket for the build status
[10:07:13.526] Build 8933153075306788992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:07:13.526] Scheduling timer "check-buildbucket-build-status" (v8/V8 NumFuzz - debug:9098583137539880064:24:0) after 1m0s
[10:08:14.879] Handling timer "check-buildbucket-build-status" (v8/V8 NumFuzz - debug:9098583137539880064:24:0)
[10:08:14.879] Timer tick, asking Buildbucket for the build status
[10:08:15.107] Build 8933153075306788992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:08:15.107] Scheduling timer "check-buildbucket-build-status" (v8/V8 NumFuzz - debug:9098583137539880064:25:0) after 1m0s
[10:09:15.308] Handling timer "check-buildbucket-build-status" (v8/V8 NumFuzz - debug:9098583137539880064:25:0)
[10:09:15.308] Timer tick, asking Buildbucket for the build status
[10:09:15.460] Build 8933153075306788992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:09:15.460] Scheduling timer "check-buildbucket-build-status" (v8/V8 NumFuzz - debug:9098583137539880064:26:0) after 1m0s
[10:10:15.993] Handling timer "check-buildbucket-build-status" (v8/V8 NumFuzz - debug:9098583137539880064:26:0)
[10:10:15.993] Timer tick, asking Buildbucket for the build status
[10:10:16.039] Build 8933153075306788992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:10:16.039] Scheduling timer "check-buildbucket-build-status" (v8/V8 NumFuzz - debug:9098583137539880064:27:0) after 1m0s
[10:11:16.461] Handling timer "check-buildbucket-build-status" (v8/V8 NumFuzz - debug:9098583137539880064:27:0)
[10:11:16.461] Timer tick, asking Buildbucket for the build status
[10:11:16.665] Build 8933153075306788992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:11:16.665] Scheduling timer "check-buildbucket-build-status" (v8/V8 NumFuzz - debug:9098583137539880064:28:0) after 1m0s
[10:12:17.401] Handling timer "check-buildbucket-build-status" (v8/V8 NumFuzz - debug:9098583137539880064:28:0)
[10:12:17.401] Timer tick, asking Buildbucket for the build status
[10:12:17.471] Build 8933153075306788992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:12:17.471] Scheduling timer "check-buildbucket-build-status" (v8/V8 NumFuzz - debug:9098583137539880064:29:0) after 1m0s
[10:13:18.003] Handling timer "check-buildbucket-build-status" (v8/V8 NumFuzz - debug:9098583137539880064:29:0)
[10:13:18.003] Timer tick, asking Buildbucket for the build status
[10:13:18.172] Build 8933153075306788992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:13:18.173] Scheduling timer "check-buildbucket-build-status" (v8/V8 NumFuzz - debug:9098583137539880064:30:0) after 1m0s
[10:14:18.728] Handling timer "check-buildbucket-build-status" (v8/V8 NumFuzz - debug:9098583137539880064:30:0)
[10:14:18.728] Timer tick, asking Buildbucket for the build status
[10:14:18.884] Build 8933153075306788992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:14:18.884] Scheduling timer "check-buildbucket-build-status" (v8/V8 NumFuzz - debug:9098583137539880064:31:0) after 1m0s
[10:15:18.916] Handling timer "check-buildbucket-build-status" (v8/V8 NumFuzz - debug:9098583137539880064:31:0)
[10:15:18.916] Timer tick, asking Buildbucket for the build status
[10:15:19.009] Build 8933153075306788992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:15:19.009] Scheduling timer "check-buildbucket-build-status" (v8/V8 NumFuzz - debug:9098583137539880064:32:0) after 1m0s
[10:16:19.048] Handling timer "check-buildbucket-build-status" (v8/V8 NumFuzz - debug:9098583137539880064:32:0)
[10:16:19.048] Timer tick, asking Buildbucket for the build status
[10:16:19.135] Build 8933153075306788992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:16:19.135] Scheduling timer "check-buildbucket-build-status" (v8/V8 NumFuzz - debug:9098583137539880064:33:0) after 1m0s
[10:17:19.161] Handling timer "check-buildbucket-build-status" (v8/V8 NumFuzz - debug:9098583137539880064:33:0)
[10:17:19.161] Timer tick, asking Buildbucket for the build status
[10:17:19.309] Build 8933153075306788992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:17:19.309] Scheduling timer "check-buildbucket-build-status" (v8/V8 NumFuzz - debug:9098583137539880064:34:0) after 1m0s
[10:18:19.332] Handling timer "check-buildbucket-build-status" (v8/V8 NumFuzz - debug:9098583137539880064:34:0)
[10:18:19.332] Timer tick, asking Buildbucket for the build status
[10:18:19.515] Build 8933153075306788992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:18:19.515] Scheduling timer "check-buildbucket-build-status" (v8/V8 NumFuzz - debug:9098583137539880064:35:0) after 1m0s
[10:19:19.535] Handling timer "check-buildbucket-build-status" (v8/V8 NumFuzz - debug:9098583137539880064:35:0)
[10:19:19.535] Timer tick, asking Buildbucket for the build status
[10:19:19.628] Build 8933153075306788992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:19:19.628] Scheduling timer "check-buildbucket-build-status" (v8/V8 NumFuzz - debug:9098583137539880064:36:0) after 1m0s
[10:20:20.468] Handling timer "check-buildbucket-build-status" (v8/V8 NumFuzz - debug:9098583137539880064:36:0)
[10:20:20.468] Timer tick, asking Buildbucket for the build status
[10:20:20.882] Build 8933153075306788992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:20:20.882] Scheduling timer "check-buildbucket-build-status" (v8/V8 NumFuzz - debug:9098583137539880064:37:0) after 1m0s
[10:21:21.949] Handling timer "check-buildbucket-build-status" (v8/V8 NumFuzz - debug:9098583137539880064:37:0)
[10:21:21.949] Timer tick, asking Buildbucket for the build status
[10:21:22.007] Build 8933153075306788992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:21:22.007] Scheduling timer "check-buildbucket-build-status" (v8/V8 NumFuzz - debug:9098583137539880064:38:0) after 1m0s
[10:22:22.619] Handling timer "check-buildbucket-build-status" (v8/V8 NumFuzz - debug:9098583137539880064:38:0)
[10:22:22.619] Timer tick, asking Buildbucket for the build status
[10:22:22.837] Build 8933153075306788992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:22:22.837] Scheduling timer "check-buildbucket-build-status" (v8/V8 NumFuzz - debug:9098583137539880064:39:0) after 1m0s
[10:23:23.150] Handling timer "check-buildbucket-build-status" (v8/V8 NumFuzz - debug:9098583137539880064:39:0)
[10:23:23.150] Timer tick, asking Buildbucket for the build status
[10:23:23.219] Build 8933153075306788992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:23:23.219] Scheduling timer "check-buildbucket-build-status" (v8/V8 NumFuzz - debug:9098583137539880064:40:0) after 1m0s
[10:24:24.376] Handling timer "check-buildbucket-build-status" (v8/V8 NumFuzz - debug:9098583137539880064:40:0)
[10:24:24.376] Timer tick, asking Buildbucket for the build status
[10:24:24.503] Build 8933153075306788992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:24:24.503] Scheduling timer "check-buildbucket-build-status" (v8/V8 NumFuzz - debug:9098583137539880064:41:0) after 1m0s
[10:25:25.663] Handling timer "check-buildbucket-build-status" (v8/V8 NumFuzz - debug:9098583137539880064:41:0)
[10:25:25.663] Timer tick, asking Buildbucket for the build status
[10:25:25.762] Build 8933153075306788992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:25:25.762] Scheduling timer "check-buildbucket-build-status" (v8/V8 NumFuzz - debug:9098583137539880064:42:0) after 1m0s
[10:26:25.848] Handling timer "check-buildbucket-build-status" (v8/V8 NumFuzz - debug:9098583137539880064:42:0)
[10:26:25.848] Timer tick, asking Buildbucket for the build status
[10:26:25.998] Build 8933153075306788992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:26:25.998] Scheduling timer "check-buildbucket-build-status" (v8/V8 NumFuzz - debug:9098583137539880064:43:0) after 1m0s
[10:27:26.050] Handling timer "check-buildbucket-build-status" (v8/V8 NumFuzz - debug:9098583137539880064:43:0)
[10:27:26.050] Timer tick, asking Buildbucket for the build status
[10:27:26.196] Build 8933153075306788992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:27:26.196] Scheduling timer "check-buildbucket-build-status" (v8/V8 NumFuzz - debug:9098583137539880064:44:0) after 1m0s
[10:28:26.245] Handling timer "check-buildbucket-build-status" (v8/V8 NumFuzz - debug:9098583137539880064:44:0)
[10:28:26.245] Timer tick, asking Buildbucket for the build status
[10:28:26.340] Build 8933153075306788992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:28:26.340] Scheduling timer "check-buildbucket-build-status" (v8/V8 NumFuzz - debug:9098583137539880064:45:0) after 1m0s
[10:29:26.365] Handling timer "check-buildbucket-build-status" (v8/V8 NumFuzz - debug:9098583137539880064:45:0)
[10:29:26.365] Timer tick, asking Buildbucket for the build status
[10:29:26.464] Build 8933153075306788992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:29:26.464] Scheduling timer "check-buildbucket-build-status" (v8/V8 NumFuzz - debug:9098583137539880064:46:0) after 1m0s
[10:30:26.531] Handling timer "check-buildbucket-build-status" (v8/V8 NumFuzz - debug:9098583137539880064:46:0)
[10:30:26.531] Timer tick, asking Buildbucket for the build status
[10:30:26.617] Build 8933153075306788992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:30:26.617] Scheduling timer "check-buildbucket-build-status" (v8/V8 NumFuzz - debug:9098583137539880064:47:0) after 1m0s
[10:31:26.685] Handling timer "check-buildbucket-build-status" (v8/V8 NumFuzz - debug:9098583137539880064:47:0)
[10:31:26.685] Timer tick, asking Buildbucket for the build status
[10:31:26.736] Build 8933153075306788992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:31:26.736] Scheduling timer "check-buildbucket-build-status" (v8/V8 NumFuzz - debug:9098583137539880064:48:0) after 1m0s
[10:32:26.756] Handling timer "check-buildbucket-build-status" (v8/V8 NumFuzz - debug:9098583137539880064:48:0)
[10:32:26.756] Timer tick, asking Buildbucket for the build status
[10:32:26.959] Build 8933153075306788992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:32:26.959] Scheduling timer "check-buildbucket-build-status" (v8/V8 NumFuzz - debug:9098583137539880064:49:0) after 1m0s
[10:33:26.977] Handling timer "check-buildbucket-build-status" (v8/V8 NumFuzz - debug:9098583137539880064:49:0)
[10:33:26.977] Timer tick, asking Buildbucket for the build status
[10:33:27.072] Build 8933153075306788992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:33:27.072] Scheduling timer "check-buildbucket-build-status" (v8/V8 NumFuzz - debug:9098583137539880064:50:0) after 1m0s
[10:34:27.152] Handling timer "check-buildbucket-build-status" (v8/V8 NumFuzz - debug:9098583137539880064:50:0)
[10:34:27.152] Timer tick, asking Buildbucket for the build status
[10:34:27.266] Build 8933153075306788992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:34:27.266] Scheduling timer "check-buildbucket-build-status" (v8/V8 NumFuzz - debug:9098583137539880064:51:0) after 1m0s
[10:35:27.967] Handling timer "check-buildbucket-build-status" (v8/V8 NumFuzz - debug:9098583137539880064:51:0)
[10:35:27.967] Timer tick, asking Buildbucket for the build status
[10:35:28.022] Build 8933153075306788992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:35:28.022] Scheduling timer "check-buildbucket-build-status" (v8/V8 NumFuzz - debug:9098583137539880064:52:0) after 1m0s
[10:36:28.260] Handling timer "check-buildbucket-build-status" (v8/V8 NumFuzz - debug:9098583137539880064:52:0)
[10:36:28.260] Timer tick, asking Buildbucket for the build status
[10:36:28.331] Build 8933153075306788992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:36:28.331] Scheduling timer "check-buildbucket-build-status" (v8/V8 NumFuzz - debug:9098583137539880064:53:0) after 1m0s
[10:37:28.457] Handling timer "check-buildbucket-build-status" (v8/V8 NumFuzz - debug:9098583137539880064:53:0)
[10:37:28.457] Timer tick, asking Buildbucket for the build status
[10:37:28.527] Build 8933153075306788992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:37:28.527] Scheduling timer "check-buildbucket-build-status" (v8/V8 NumFuzz - debug:9098583137539880064:54:0) after 1m0s
[10:38:29.247] Handling timer "check-buildbucket-build-status" (v8/V8 NumFuzz - debug:9098583137539880064:54:0)
[10:38:29.247] Timer tick, asking Buildbucket for the build status
[10:38:29.343] Build 8933153075306788992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:38:29.343] Scheduling timer "check-buildbucket-build-status" (v8/V8 NumFuzz - debug:9098583137539880064:55:0) after 1m0s
[10:39:30.178] Handling timer "check-buildbucket-build-status" (v8/V8 NumFuzz - debug:9098583137539880064:55:0)
[10:39:30.178] Timer tick, asking Buildbucket for the build status
[10:39:30.295] Build 8933153075306788992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:39:30.295] Scheduling timer "check-buildbucket-build-status" (v8/V8 NumFuzz - debug:9098583137539880064:56:0) after 1m0s
[10:40:30.957] Handling timer "check-buildbucket-build-status" (v8/V8 NumFuzz - debug:9098583137539880064:56:0)
[10:40:30.957] Timer tick, asking Buildbucket for the build status
[10:40:31.364] Build 8933153075306788992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:40:31.364] Scheduling timer "check-buildbucket-build-status" (v8/V8 NumFuzz - debug:9098583137539880064:57:0) after 1m0s
[10:41:32.529] Handling timer "check-buildbucket-build-status" (v8/V8 NumFuzz - debug:9098583137539880064:57:0)
[10:41:32.529] Timer tick, asking Buildbucket for the build status
[10:41:32.689] Build 8933153075306788992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:41:32.689] Scheduling timer "check-buildbucket-build-status" (v8/V8 NumFuzz - debug:9098583137539880064:58:0) after 1m0s
[10:42:32.919] Handling timer "check-buildbucket-build-status" (v8/V8 NumFuzz - debug:9098583137539880064:58:0)
[10:42:32.919] Timer tick, asking Buildbucket for the build status
[10:42:32.971] Build 8933153075306788992: status "STARTED", result "", failure_reason "", cancelation_reason ""
[10:42:32.971] Scheduling timer "check-buildbucket-build-status" (v8/V8 NumFuzz - debug:9098583137539880064:59:0) after 1m0s
[10:43:20.444] Received PubSub notification, asking Buildbucket for the build status
[10:43:20.537] Build 8933153075306788992: status "COMPLETED", result "FAILURE", failure_reason "INFRA_FAILURE", cancelation_reason ""
[10:43:20.537] Buildbucket build:
{
"build": {
"bucket": "luci.v8.ci",
"canary": true,
"canary_preference": "AUTO",
"completed_ts": "1539081798934226",
"created_by": "user:luci-scheduler@appspot.gserviceaccount.com",
"created_ts": "1539078369762676",
"failure_reason": "INFRA_FAILURE",
"id": "8933153075306788992",
"parameters_json": "{\"builder_name\": \"V8 NumFuzz - debug\", \"properties\": {\"parent_build_config\": \"Debug\", \"parent_build_environment\": {\"gn_args\": \"is_component_build = true is_debug = true target_cpu = \\\"x64\\\" use_goma = true v8_enable_backtrace = true v8_enable_slow_dchecks = true\"}, \"parent_buildername\": \"V8 Clusterfuzz Linux64 - debug builder\", \"parent_got_revision\": \"d46467c0d2a7fc9285ebf6f20ad0a7f1b24a73bd\", \"parent_got_revision_cp\": \"refs/heads/master@{#56468}\", \"parent_got_swarming_client_revision\": \"486c9b53c4d54dd4b95bb6ce0e31160e600dfc11\", \"revision\": \"d46467c0d2a7fc9285ebf6f20ad0a7f1b24a73bd\", \"swarm_hashes\": {\"d8_default\": \"54326b2550f6992d5e97754de289ea3ac2d48078\", \"run-num-fuzzer\": \"33a8f33ad19eb6a1deb1eba69bd4791ee2a18050\"}}}",
"project": "v8",
"result": "FAILURE",
"result_details_json": "{\"ui\": {\"info\": \"Failure Num Fuzz - combined\\nFailure Num Fuzz - endurance\\nFailure Uncaught Exception\"}, \"build_run_result\": {\"infraFailure\": {\"text\": \"recipe infra failure: Uncaught Exception: TypeError(\\\"object of type 'NoneType' has no len()\\\",)\", \"bootstrapperCallStack\": [], \"type\": \"RECIPE_INFRA_FAILURE\"}, \"recipeResult\": {\"failure\": {\"exception\": {\"traceback\": [\"Traceback (most recent call last):\", \" File \\\"/b/swarming/w/ir/kitchen-checkout/recipe_engine/recipe_engine/run.py\\\", line 298, in _new_run\", \" recipe_result = recipe_script.run(api, self.properties, self.environ)\", \" File \\\"/b/swarming/w/ir/kitchen-checkout/recipe_engine/recipe_engine/loader.py\\\", line 108, in run\", \" self.run_steps, properties, environ, self.PROPERTIES, api=api)\", \" File \\\"/b/swarming/w/ir/kitchen-checkout/recipe_engine/recipe_engine/loader.py\\\", line 636, in invoke_with_properties\", \" arg_names, **additional_args)\", \" File \\\"/b/swarming/w/ir/kitchen-checkout/recipe_engine/recipe_engine/loader.py\\\", line 599, in _invoke_with_properties\", \" return callable_obj(*props, **additional_args)\", \" File \\\"/b/swarming/w/ir/kitchen-checkout/build/scripts/slave/recipes/v8.py\\\", line 131, in RunSteps\", \" test_results = v8.runtests(tests)\", \" File \\\"/b/swarming/w/ir/kitchen-checkout/recipe_engine/recipe_engine/recipe_api.py\\\", line 765, in _inner\", \" return func(*a, **kw)\", \" File \\\"/b/swarming/w/ir/kitchen-checkout/build/scripts/slave/recipe_modules/v8/api.py\\\", line 1004, in runtests\", \" test_results += t.run(coverage_context=coverage_context)\", \" File \\\"/b/swarming/w/ir/kitchen-checkout/build/scripts/slave/recipe_modules/v8/testing.py\\\", line 572, in run\", \" return result + self.post_run(self.test, coverage_context)\", \" File \\\"/b/swarming/w/ir/kitchen-checkout/build/scripts/slave/recipe_modules/v8/testing.py\\\", line 395, in post_run\", \" assert len(json_output) == 1\", \"TypeError: object of type 'NoneType' has no len()\"]}, \"humanReason\": \"Uncaught Exception: TypeError(\\\"object of type 'NoneType' has no len()\\\",)\"}}, \"recipeExitCode\": {\"value\": 1}, \"recipe\": {\"name\": \"v8\", \"repository\": \"\", \"revision\": \"\"}, \"annotationUrl\": \"logdog://logs.chromium.org/v8/buildbucket/cr-buildbucket.appspot.com/8933153075306788992/+/annotations\"}, \"swarming\": {\"bot_dimensions\": {\"zone\": [\"us\", \"us-central\", \"us-central1\", \"us-central1-f\"], \"inside_docker\": [\"1\", \"stock\"], \"python\": [\"2.7.6\"], \"image\": [\"chrome-trusty-18042300-b7223b463e3\"], \"kvm\": [\"0\"], \"gpu\": [\"none\"], \"cpu\": [\"x86\", \"x86-64\", \"x86-64-Ivy_Bridge_GCE\"], \"server_version\": [\"3806-b2aa68c\"], \"machine_type\": [\"n1-standard-8\"], \"host_class\": [\"multibot\"], \"cores\": [\"8\"], \"os\": [\"Linux\", \"Ubuntu\", \"Ubuntu-14.04\"], \"id\": [\"swarm-docker-5-c4--022\"], \"pool\": [\"luci.v8.ci\"], \"caches\": [\"vpython\"]}}, \"properties\": {\"$recipe_engine/path\": {\"cache_dir\": \"/b/swarming/w/ir/cache\", \"temp_dir\": \"/b/swarming/w/ir/tmp/rt\"}, \"buildnumber\": 3172, \"parent_buildername\": \"V8 Clusterfuzz Linux64 - debug builder\", \"parent_got_swarming_client_revision\": \"486c9b53c4d54dd4b95bb6ce0e31160e600dfc11\", \"buildername\": \"V8 NumFuzz - debug\", \"got_revision\": \"d46467c0d2a7fc9285ebf6f20ad0a7f1b24a73bd\", \"parent_build_environment\": {\"gn_args\": \"is_component_build = true is_debug = true target_cpu = \\\"x64\\\" use_goma = true v8_enable_backtrace = true v8_enable_slow_dchecks = true\"}, \"recipe\": \"v8\", \"mastername\": \"client.v8.clusterfuzz\", \"parent_got_revision\": \"d46467c0d2a7fc9285ebf6f20ad0a7f1b24a73bd\", \"$recipe_engine/runtime\": {\"is_experimental\": false, \"is_luci\": true}, \"buildbucket\": {\"hostname\": \"cr-buildbucket.appspot.com\", \"build\": {\"created_ts\": 1539078369762676, \"tags\": [\"builder:V8 NumFuzz - debug\", \"buildset:commit/gitiles/chromium.googlesource.com/v8/v8/+/d46467c0d2a7fc9285ebf6f20ad0a7f1b24a73bd\", \"gitiles_ref:refs/heads/master\", \"parent_buildername:V8 Clusterfuzz Linux64 - debug builder\", \"parent_buildnumber:3845\", \"scheduler_invocation_id:9098583137539880064\", \"scheduler_job_id:v8/V8 NumFuzz - debug\", \"user_agent:luci-scheduler\", \"user_agent:recipe\"], \"bucket\": \"luci.v8.ci\", \"created_by\": \"user:luci-scheduler@appspot.gserviceaccount.com\", \"project\": \"v8\", \"id\": \"8933153075306788992\"}}, \"got_revision_cp\": \"refs/heads/master@{#56468}\", \"swarm_hashes\": {\"d8_default\": \"54326b2550f6992d5e97754de289ea3ac2d48078\", \"run-num-fuzzer\": \"33a8f33ad19eb6a1deb1eba69bd4791ee2a18050\"}, \"parent_got_revision_cp\": \"refs/heads/master@{#56468}\", \"path_config\": \"generic\", \"revision\": \"d46467c0d2a7fc9285ebf6f20ad0a7f1b24a73bd\", \"parent_build_config\": \"Debug\", \"bot_id\": \"swarm-docker-5-c4--022\"}}",
"service_account": "v8-ci-builder@chops-service-accounts.iam.gserviceaccount.com",
"started_ts": "1539078370425305",
"status": "COMPLETED",
"status_changed_ts": "1539081799786611",
"tags": [
"build_address:luci.v8.ci/V8 NumFuzz - debug/3172",
"builder:V8 NumFuzz - debug",
"buildset:commit/gitiles/chromium.googlesource.com/v8/v8/+/d46467c0d2a7fc9285ebf6f20ad0a7f1b24a73bd",
"gitiles_ref:refs/heads/master",
"parent_buildername:V8 Clusterfuzz Linux64 - debug builder",
"parent_buildnumber:3845",
"scheduler_invocation_id:9098583137539880064",
"scheduler_job_id:v8/V8 NumFuzz - debug",
"swarming_dimension:host_class:multibot",
"swarming_dimension:pool:luci.v8.ci",
"swarming_hostname:chromium-swarm.appspot.com",
"swarming_tag:build_address:luci.v8.ci/V8 NumFuzz - debug/3172",
"swarming_tag:buildbucket_bucket:luci.v8.ci",
"swarming_tag:buildbucket_build_id:8933153075306788992",
"swarming_tag:buildbucket_hostname:cr-buildbucket.appspot.com",
"swarming_tag:buildbucket_template_canary:1",
"swarming_tag:buildbucket_template_revision:4c790cbde9342069ed9b59b6709c8807b14f2913",
"swarming_tag:builder:V8 NumFuzz - debug",
"swarming_tag:buildset:commit/gitiles/chromium.googlesource.com/v8/v8/+/d46467c0d2a7fc9285ebf6f20ad0a7f1b24a73bd",
"swarming_tag:gitiles_ref:refs/heads/master",
"swarming_tag:host_class:multibot",
"swarming_tag:log_location:logdog://logs.chromium.org/v8/buildbucket/cr-buildbucket.appspot.com/8933153075306788992/+/annotations",
"swarming_tag:luci_project:v8",
"swarming_tag:parent_buildername:V8 Clusterfuzz Linux64 - debug builder",
"swarming_tag:parent_buildnumber:3845",
"swarming_tag:pool:luci.v8.ci",
"swarming_tag:priority:30",
"swarming_tag:recipe_name:v8",
"swarming_tag:recipe_package:infra/recipe_bundles/chromium.googlesource.com/chromium/tools/build",
"swarming_tag:scheduler_invocation_id:9098583137539880064",
"swarming_tag:scheduler_job_id:v8/V8 NumFuzz - debug",
"swarming_tag:service_account:v8-ci-builder@chops-service-accounts.iam.gserviceaccount.com",
"swarming_tag:swarming.pool.template:skip",
"swarming_tag:swarming.pool.version:02bdf727c78e311c1f6a89f60a30eee8127f12a8",
"swarming_tag:user:None",
"swarming_tag:user_agent:luci-scheduler",
"swarming_tag:user_agent:recipe",
"swarming_tag:vpython:native-python-wrapper",
"swarming_task_id:407109bb2290ac10",
"user_agent:luci-scheduler",
"user_agent:recipe"
],
"updated_ts": "1539081799789166",
"url": "https://ci.chromium.org/p/v8/builders/luci.v8.ci/V8 NumFuzz - debug/3172",
"utcnow_ts": "1539081800481203"
}
}
[10:43:20.537] Invocation finished in 57m12.287387959s with status FAILED