builder: mozilla-inbound_ubuntu64_hw_test-dromaeojs-pgo slave: talos-linux64-ix-057 starttime: 1479986317.45 results: success (0) buildid: 20161124031739 builduid: b2831325ecc3462ab6600428c10a9f28 revision: f9e3af2b0e9913d87e031ec993bd25a41d82cafb ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2016-11-24 03:18:37.446683) ========= master: http://buildbot-master105.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2016-11-24 03:18:37.447204) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-11-24 03:18:37.447548) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-11-24 03:18:37.473770) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-11-24 03:18:37.474074) ========= bash -c 'wget -Oarchiver_client.py --no-check-certificate --tries=10 --waitretry=3 https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py' in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', 'wget -Oarchiver_client.py --no-check-certificate --tries=10 --waitretry=3 https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=934fc3100db09dcb9af4d4b6000001ab-1479977898.495261-576708901 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2016-11-24 03:18:37-- https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py Resolving hg.mozilla.org (hg.mozilla.org)... 63.245.215.102, 63.245.215.25 Connecting to hg.mozilla.org (hg.mozilla.org)|63.245.215.102|:443... connected. HTTP request sent, awaiting response... 200 Script output follows Length: 12179 (12K) [text/x-python] Saving to: `archiver_client.py' 0K .......... . 100% 217M=0s 2016-11-24 03:18:38 (217 MB/s) - `archiver_client.py' saved [12179/12179] program finished with exit code 0 elapsedTime=0.082017 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-11-24 03:18:37.573492) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-11-24 03:18:37.573846) ========= rm -rf scripts properties in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['rm', '-rf', 'scripts', 'properties'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=934fc3100db09dcb9af4d4b6000001ab-1479977898.495261-576708901 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.016795 ========= master_lag: 0.04 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-11-24 03:18:37.634601) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 1 secs) (at 2016-11-24 03:18:37.634968) ========= bash -c 'python archiver_client.py mozharness --repo integration/mozilla-inbound --rev f9e3af2b0e9913d87e031ec993bd25a41d82cafb --destination scripts --debug' in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', u'python archiver_client.py mozharness --repo integration/mozilla-inbound --rev f9e3af2b0e9913d87e031ec993bd25a41d82cafb --destination scripts --debug'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=934fc3100db09dcb9af4d4b6000001ab-1479977898.495261-576708901 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2016-11-24 03:18:38,202 truncating revision to first 12 chars 2016-11-24 03:18:38,202 Setting DEBUG logging. 2016-11-24 03:18:38,202 attempt 1/10 2016-11-24 03:18:38,202 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/integration/mozilla-inbound/f9e3af2b0e99?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2016-11-24 03:18:38,913 unpacking tar archive at: mozilla-inbound-f9e3af2b0e99/testing/mozharness/ program finished with exit code 0 elapsedTime=1.037324 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 1 secs) (at 2016-11-24 03:18:38.687200) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-11-24 03:18:38.687536) ========= script_repo_revision: f9e3af2b0e9913d87e031ec993bd25a41d82cafb ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-11-24 03:18:38.687982) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-11-24 03:18:38.688306) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-11-24 03:18:38.697172) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 49 secs) (at 2016-11-24 03:18:38.697552) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs --add-option --webServer,localhost --branch-name Mozilla-Inbound --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Mozilla-Inbound in dir /builds/slave/test/. (timeout 3600 secs) (maxTime 7200 secs) watching logfiles {} argv: ['/tools/buildbot/bin/python', 'scripts/scripts/talos_script.py', '--suite', 'dromaeojs', '--add-option', '--webServer,localhost', '--branch-name', 'Mozilla-Inbound', '--cfg', 'talos/linux_config.py', '--download-symbols', 'ondemand', '--use-talos-json', '--blob-upload-branch', 'Mozilla-Inbound'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PROPERTIES_FILE=/builds/slave/test/buildprops.json PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=934fc3100db09dcb9af4d4b6000001ab-1479977898.495261-576708901 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 03:18:39 INFO - MultiFileLogger online at 20161124 03:18:39 in /builds/slave/test 03:18:39 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs --add-option --webServer,localhost --branch-name Mozilla-Inbound --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Mozilla-Inbound 03:18:39 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 03:18:39 INFO - {'append_to_log': False, 03:18:39 INFO - 'base_work_dir': '/builds/slave/test', 03:18:39 INFO - 'blob_upload_branch': 'Mozilla-Inbound', 03:18:39 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 03:18:39 INFO - 'branch': 'Mozilla-Inbound', 03:18:39 INFO - 'buildbot_json_path': 'buildprops.json', 03:18:39 INFO - 'config_files': ('talos/linux_config.py',), 03:18:39 INFO - 'default_actions': ('clobber', 03:18:39 INFO - 'read-buildbot-config', 03:18:39 INFO - 'download-and-extract', 03:18:39 INFO - 'populate-webroot', 03:18:39 INFO - 'create-virtualenv', 03:18:39 INFO - 'install', 03:18:39 INFO - 'run-tests'), 03:18:39 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 03:18:39 INFO - 'download_minidump_stackwalk': True, 03:18:39 INFO - 'download_symbols': 'ondemand', 03:18:39 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 03:18:39 INFO - 'tooltool.py': '/tools/tooltool.py', 03:18:39 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 03:18:39 INFO - '/tools/misc-python/virtualenv.py')}, 03:18:39 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 03:18:39 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 03:18:39 INFO - 'installer_path': 'installer.exe', 03:18:39 INFO - 'log_level': 'info', 03:18:39 INFO - 'log_name': 'talos', 03:18:39 INFO - 'log_to_console': True, 03:18:39 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 03:18:39 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 03:18:39 INFO - 'opt_config_files': (), 03:18:39 INFO - 'pip_index': False, 03:18:39 INFO - 'sps_profile': False, 03:18:39 INFO - 'sps_profile_interval': 0, 03:18:39 INFO - 'suite': 'dromaeojs', 03:18:39 INFO - 'system_bits': '32', 03:18:39 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 03:18:39 INFO - 'title': 'talos-linux64-ix-057', 03:18:39 INFO - 'tooltool_cache': '/builds/tooltool_cache', 03:18:39 INFO - 'use_talos_json': True, 03:18:39 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 03:18:39 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 03:18:39 INFO - 'work_dir': 'build'} 03:18:39 INFO - [mozharness: 2016-11-24 11:18:39.363886Z] Running clobber step. 03:18:39 INFO - Running pre-action listener: _resource_record_pre_action 03:18:39 INFO - Running main action method: clobber 03:18:39 INFO - rmtree: /builds/slave/test/build 03:18:39 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 03:18:39 INFO - Running post-action listener: _resource_record_post_action 03:18:39 INFO - [mozharness: 2016-11-24 11:18:39.830016Z] Finished clobber step (success) 03:18:39 INFO - [mozharness: 2016-11-24 11:18:39.830116Z] Running read-buildbot-config step. 03:18:39 INFO - Running pre-action listener: _resource_record_pre_action 03:18:39 INFO - Running main action method: read_buildbot_config 03:18:39 INFO - Using buildbot properties: 03:18:39 INFO - { 03:18:39 INFO - "project": "", 03:18:39 INFO - "product": "firefox", 03:18:39 INFO - "script_repo_revision": "production", 03:18:39 INFO - "builddir": "mozilla-inbound_ubuntu64_hw_test-dromaeojs", 03:18:39 INFO - "repository": "", 03:18:39 INFO - "buildername": "Ubuntu HW 12.04 x64 mozilla-inbound pgo talos dromaeojs", 03:18:39 INFO - "buildid": "20161124031739", 03:18:39 INFO - "stage_platform": "linux64-pgo", 03:18:39 INFO - "basedir": "/builds/slave/test", 03:18:39 INFO - "buildnumber": 2146, 03:18:39 INFO - "platform": "ubuntu64_hw", 03:18:39 INFO - "master": "http://buildbot-master105.bb.releng.scl3.mozilla.com:8201/", 03:18:39 INFO - "slavebuilddir": "test", 03:18:39 INFO - "branch": "mozilla-inbound", 03:18:39 INFO - "revision": "f9e3af2b0e9913d87e031ec993bd25a41d82cafb", 03:18:39 INFO - "slavename": "talos-linux64-ix-057", 03:18:39 INFO - "builduid": "b2831325ecc3462ab6600428c10a9f28", 03:18:39 INFO - "repo_path": "integration/mozilla-inbound" 03:18:39 INFO - } 03:18:39 INFO - Found installer url https://archive.mozilla.org/pub/firefox/tinderbox-builds/mozilla-inbound-linux64-pgo/1479976410/firefox-53.0a1.en-US.linux-x86_64.tar.bz2. 03:18:39 INFO - Found a test packages url https://archive.mozilla.org/pub/firefox/tinderbox-builds/mozilla-inbound-linux64-pgo/1479976410/firefox-53.0a1.en-US.linux-x86_64.test_packages.json. 03:18:39 INFO - Running post-action listener: _resource_record_post_action 03:18:39 INFO - [mozharness: 2016-11-24 11:18:39.832474Z] Finished read-buildbot-config step (success) 03:18:39 INFO - [mozharness: 2016-11-24 11:18:39.832563Z] Running download-and-extract step. 03:18:39 INFO - Running pre-action listener: _resource_record_pre_action 03:18:39 INFO - Running main action method: download_and_extract 03:18:39 INFO - mkdir: /builds/slave/test/build/tests 03:18:39 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 03:18:39 INFO - trying https://archive.mozilla.org/pub/firefox/tinderbox-builds/mozilla-inbound-linux64-pgo/1479976410/firefox-53.0a1.en-US.linux-x86_64.test_packages.json 03:18:39 INFO - Downloading https://archive.mozilla.org/pub/firefox/tinderbox-builds/mozilla-inbound-linux64-pgo/1479976410/firefox-53.0a1.en-US.linux-x86_64.test_packages.json to /builds/slave/test/build/firefox-53.0a1.en-US.linux-x86_64.test_packages.json 03:18:39 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://archive.mozilla.org/pub/firefox/tinderbox-builds/mozilla-inbound-linux64-pgo/1479976410/firefox-53.0a1.en-US.linux-x86_64.test_packages.json', 'file_name': '/builds/slave/test/build/firefox-53.0a1.en-US.linux-x86_64.test_packages.json'}, attempt #1 03:18:39 INFO - Downloaded 1361 bytes. 03:18:39 INFO - Reading from file /builds/slave/test/build/firefox-53.0a1.en-US.linux-x86_64.test_packages.json 03:18:39 INFO - Using the following test package requirements: 03:18:39 INFO - {u'common': [u'firefox-53.0a1.en-US.linux-x86_64.common.tests.zip'], 03:18:39 INFO - u'cppunittest': [u'firefox-53.0a1.en-US.linux-x86_64.common.tests.zip', 03:18:39 INFO - u'firefox-53.0a1.en-US.linux-x86_64.cppunittest.tests.zip'], 03:18:39 INFO - u'gtest': [u'firefox-53.0a1.en-US.linux-x86_64.common.tests.zip', 03:18:39 INFO - u'firefox-53.0a1.en-US.linux-x86_64.gtest.tests.zip'], 03:18:39 INFO - u'jittest': [u'firefox-53.0a1.en-US.linux-x86_64.common.tests.zip', 03:18:39 INFO - u'jsshell-linux-x86_64.zip'], 03:18:39 INFO - u'mochitest': [u'firefox-53.0a1.en-US.linux-x86_64.common.tests.zip', 03:18:39 INFO - u'firefox-53.0a1.en-US.linux-x86_64.mochitest.tests.zip'], 03:18:39 INFO - u'mozbase': [u'firefox-53.0a1.en-US.linux-x86_64.common.tests.zip'], 03:18:39 INFO - u'reftest': [u'firefox-53.0a1.en-US.linux-x86_64.common.tests.zip', 03:18:39 INFO - u'firefox-53.0a1.en-US.linux-x86_64.reftest.tests.zip'], 03:18:39 INFO - u'talos': [u'firefox-53.0a1.en-US.linux-x86_64.common.tests.zip', 03:18:39 INFO - u'firefox-53.0a1.en-US.linux-x86_64.talos.tests.zip'], 03:18:39 INFO - u'web-platform': [u'firefox-53.0a1.en-US.linux-x86_64.common.tests.zip', 03:18:39 INFO - u'firefox-53.0a1.en-US.linux-x86_64.web-platform.tests.zip'], 03:18:39 INFO - u'xpcshell': [u'firefox-53.0a1.en-US.linux-x86_64.common.tests.zip', 03:18:39 INFO - u'firefox-53.0a1.en-US.linux-x86_64.xpcshell.tests.zip']} 03:18:39 INFO - Downloading packages: [u'firefox-53.0a1.en-US.linux-x86_64.common.tests.zip'] for test suite category: common 03:18:39 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://archive.mozilla.org/pub/firefox/tinderbox-builds/mozilla-inbound-linux64-pgo/1479976410/firefox-53.0a1.en-US.linux-x86_64.common.tests.zip 03:18:39 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://archive.mozilla.org/pub/firefox/tinderbox-builds/mozilla-inbound-linux64-pgo/1479976410/firefox-53.0a1.en-US.linux-x86_64.common.tests.zip'}, attempt #1 03:18:39 INFO - Fetch https://archive.mozilla.org/pub/firefox/tinderbox-builds/mozilla-inbound-linux64-pgo/1479976410/firefox-53.0a1.en-US.linux-x86_64.common.tests.zip into memory 03:18:40 INFO - Http code: 200 03:18:40 INFO - via: 1.1 49c80a47c1441dd194a8337982f1cd7e.cloudfront.net (CloudFront) 03:18:40 INFO - x-amz-cf-id: v8w4SJ2LRwibl9IhWAzhL1l6k6crEdUl1T3-dRdOTwkDO3L7GRu4Lw== 03:18:40 INFO - x-amz-replication-status: COMPLETED 03:18:40 INFO - x-amz-version-id: V2hBhUbkzVqPs7ghT3GBip0AhWQb4Fzn 03:18:43 INFO - Expected file size: 21765916 03:18:43 INFO - Obtained file size: 21765916 03:18:47 INFO - Downloading packages: [u'firefox-53.0a1.en-US.linux-x86_64.common.tests.zip', u'firefox-53.0a1.en-US.linux-x86_64.talos.tests.zip'] for test suite category: talos 03:18:47 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://archive.mozilla.org/pub/firefox/tinderbox-builds/mozilla-inbound-linux64-pgo/1479976410/firefox-53.0a1.en-US.linux-x86_64.common.tests.zip 03:18:47 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://archive.mozilla.org/pub/firefox/tinderbox-builds/mozilla-inbound-linux64-pgo/1479976410/firefox-53.0a1.en-US.linux-x86_64.common.tests.zip'}, attempt #1 03:18:47 INFO - Fetch https://archive.mozilla.org/pub/firefox/tinderbox-builds/mozilla-inbound-linux64-pgo/1479976410/firefox-53.0a1.en-US.linux-x86_64.common.tests.zip into memory 03:18:47 INFO - Http code: 200 03:18:47 INFO - via: 1.1 0cf1d7257c633ae75623c5e75bf3805e.cloudfront.net (CloudFront) 03:18:47 INFO - x-amz-cf-id: nvga39_LXc-nSvH0s7_6OWJRumxfCpuiofS9wLjbi1DYKM2Y4XPmXQ== 03:18:47 INFO - x-amz-replication-status: COMPLETED 03:18:47 INFO - x-amz-version-id: V2hBhUbkzVqPs7ghT3GBip0AhWQb4Fzn 03:18:47 INFO - Expected file size: 21765916 03:18:47 INFO - Obtained file size: 21765916 03:18:52 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://archive.mozilla.org/pub/firefox/tinderbox-builds/mozilla-inbound-linux64-pgo/1479976410/firefox-53.0a1.en-US.linux-x86_64.talos.tests.zip 03:18:52 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://archive.mozilla.org/pub/firefox/tinderbox-builds/mozilla-inbound-linux64-pgo/1479976410/firefox-53.0a1.en-US.linux-x86_64.talos.tests.zip'}, attempt #1 03:18:52 INFO - Fetch https://archive.mozilla.org/pub/firefox/tinderbox-builds/mozilla-inbound-linux64-pgo/1479976410/firefox-53.0a1.en-US.linux-x86_64.talos.tests.zip into memory 03:18:52 INFO - Http code: 200 03:18:52 INFO - via: 1.1 9552af4ceb2e0dd55964a80d1e549fd5.cloudfront.net (CloudFront) 03:18:52 INFO - x-amz-cf-id: U9Y7LfrV45aV-7yf7I_Ow1bqN4JAi9nAoSIHQwnX26aCrsyQr-W-kQ== 03:18:52 INFO - x-amz-replication-status: COMPLETED 03:18:52 INFO - x-amz-version-id: PncNxtDZqm_yxFi4DC0pBAOjYsYrOwqO 03:18:55 INFO - Expected file size: 14409749 03:18:55 INFO - Obtained file size: 14409749 03:18:55 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 03:18:55 INFO - trying https://archive.mozilla.org/pub/firefox/tinderbox-builds/mozilla-inbound-linux64-pgo/1479976410/firefox-53.0a1.en-US.linux-x86_64.tar.bz2 03:18:55 INFO - Downloading https://archive.mozilla.org/pub/firefox/tinderbox-builds/mozilla-inbound-linux64-pgo/1479976410/firefox-53.0a1.en-US.linux-x86_64.tar.bz2 to /builds/slave/test/build/firefox-53.0a1.en-US.linux-x86_64.tar.bz2 03:18:55 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://archive.mozilla.org/pub/firefox/tinderbox-builds/mozilla-inbound-linux64-pgo/1479976410/firefox-53.0a1.en-US.linux-x86_64.tar.bz2', 'file_name': '/builds/slave/test/build/firefox-53.0a1.en-US.linux-x86_64.tar.bz2'}, attempt #1 03:19:00 INFO - Downloaded 59750123 bytes. 03:19:00 INFO - Setting buildbot property build_url to https://archive.mozilla.org/pub/firefox/tinderbox-builds/mozilla-inbound-linux64-pgo/1479976410/firefox-53.0a1.en-US.linux-x86_64.tar.bz2 03:19:00 INFO - mkdir: /builds/slave/test/properties 03:19:00 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 03:19:00 INFO - Writing to file /builds/slave/test/properties/build_url 03:19:00 INFO - Contents: 03:19:00 INFO - build_url:https://archive.mozilla.org/pub/firefox/tinderbox-builds/mozilla-inbound-linux64-pgo/1479976410/firefox-53.0a1.en-US.linux-x86_64.tar.bz2 03:19:00 INFO - Running post-action listener: _resource_record_post_action 03:19:00 INFO - Running post-action listener: set_extra_try_arguments 03:19:00 INFO - [mozharness: 2016-11-24 11:19:00.541978Z] Finished download-and-extract step (success) 03:19:00 INFO - [mozharness: 2016-11-24 11:19:00.542206Z] Running populate-webroot step. 03:19:00 INFO - Running pre-action listener: _resource_record_pre_action 03:19:00 INFO - Running main action method: populate_webroot 03:19:00 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 03:19:00 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 03:19:00 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 03:19:00 INFO - '--tppagecycles', 03:19:00 INFO - '7'], 03:19:00 INFO - 'tests': ['tsvgm']}}, 03:19:00 INFO - 'suites': {'chromez': {'talos_options': ['--disable-e10s'], 03:19:00 INFO - 'tests': ['tresize', 'tcanvasmark']}, 03:19:00 INFO - 'chromez-e10s': {'tests': ['tresize', 'tcanvasmark']}, 03:19:00 INFO - 'dromaeojs': {'talos_options': ['--disable-e10s'], 03:19:00 INFO - 'tests': ['dromaeo_css', 'kraken']}, 03:19:00 INFO - 'dromaeojs-e10s': {'tests': ['dromaeo_css', 'kraken']}, 03:19:00 INFO - 'g1': {'pagesets_name': 'tp5n.zip', 03:19:00 INFO - 'talos_options': ['--disable-e10s'], 03:19:00 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 03:19:00 INFO - 'g1-e10s': {'pagesets_name': 'tp5n.zip', 03:19:00 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 03:19:00 INFO - 'g2': {'pagesets_name': 'tp5n.zip', 03:19:00 INFO - 'talos_options': ['--disable-e10s'], 03:19:00 INFO - 'tests': ['damp', 'tps']}, 03:19:00 INFO - 'g2-e10s': {'pagesets_name': 'tp5n.zip', 03:19:00 INFO - 'tests': ['damp', 'tps']}, 03:19:00 INFO - 'g3': {'talos_options': ['--disable-e10s'], 03:19:00 INFO - 'tests': ['dromaeo_dom']}, 03:19:00 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 03:19:00 INFO - 'g4': {'talos_options': ['--disable-e10s'], 03:19:00 INFO - 'tests': ['basic_compositor_video']}, 03:19:00 INFO - 'g4-e10s': {'tests': ['basic_compositor_video']}, 03:19:00 INFO - 'other': {'talos_options': ['--disable-e10s'], 03:19:00 INFO - 'tests': ['a11yr', 03:19:00 INFO - 'ts_paint', 03:19:00 INFO - 'tpaint', 03:19:00 INFO - 'sessionrestore', 03:19:00 INFO - 'sessionrestore_no_auto_restore', 03:19:00 INFO - 'tabpaint']}, 03:19:00 INFO - 'other-e10s': {'tests': ['a11yr', 03:19:00 INFO - 'ts_paint', 03:19:00 INFO - 'tpaint', 03:19:00 INFO - 'sessionrestore', 03:19:00 INFO - 'sessionrestore_no_auto_restore', 03:19:00 INFO - 'tabpaint']}, 03:19:00 INFO - 'other-e10s_l64': {'tests': ['a11yr', 03:19:00 INFO - 'ts_paint', 03:19:00 INFO - 'tpaint', 03:19:00 INFO - 'sessionrestore', 03:19:00 INFO - 'sessionrestore_no_auto_restore', 03:19:00 INFO - 'tabpaint']}, 03:19:00 INFO - 'other-e10s_nol64': {'tests': ['a11yr', 03:19:00 INFO - 'ts_paint', 03:19:00 INFO - 'tpaint', 03:19:00 INFO - 'sessionrestore', 03:19:00 INFO - 'sessionrestore_no_auto_restore', 03:19:00 INFO - 'tabpaint']}, 03:19:00 INFO - 'other_l64': {'talos_options': ['--disable-e10s'], 03:19:00 INFO - 'tests': ['a11yr', 03:19:00 INFO - 'ts_paint', 03:19:00 INFO - 'tpaint', 03:19:00 INFO - 'sessionrestore', 03:19:00 INFO - 'sessionrestore_no_auto_restore', 03:19:00 INFO - 'tabpaint']}, 03:19:00 INFO - 'other_nol64': {'talos_options': ['--disable-e10s'], 03:19:00 INFO - 'tests': ['a11yr', 03:19:00 INFO - 'ts_paint', 03:19:00 INFO - 'tpaint', 03:19:00 INFO - 'sessionrestore', 03:19:00 INFO - 'sessionrestore_no_auto_restore', 03:19:00 INFO - 'tabpaint']}, 03:19:00 INFO - 'svgr': {'talos_options': ['--disable-e10s'], 03:19:00 INFO - 'tests': ['tsvgx', 03:19:00 INFO - 'tsvgr_opacity', 03:19:00 INFO - 'tart', 03:19:00 INFO - 'tscrollx', 03:19:00 INFO - 'cart', 03:19:00 INFO - 'tsvg_static']}, 03:19:00 INFO - 'svgr-e10s': {'tests': ['tsvgx', 03:19:00 INFO - 'tsvgr_opacity', 03:19:00 INFO - 'tart', 03:19:00 INFO - 'tscrollx', 03:19:00 INFO - 'cart', 03:19:00 INFO - 'tsvg_static']}, 03:19:00 INFO - 'tp5o': {'pagesets_name': 'tp5n.zip', 03:19:00 INFO - 'talos_options': ['--disable-e10s'], 03:19:00 INFO - 'tests': ['tp5o']}, 03:19:00 INFO - 'tp5o-e10s': {'pagesets_name': 'tp5n.zip', 'tests': ['tp5o']}, 03:19:00 INFO - 'xperf': {'pagesets_name': 'tp5n.zip', 03:19:00 INFO - 'talos_options': ['--disable-e10s', 03:19:00 INFO - '--xperf_path', 03:19:00 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 03:19:00 INFO - 'tests': ['tp5n']}, 03:19:00 INFO - 'xperf-e10s': {'pagesets_name': 'tp5n.zip', 03:19:00 INFO - 'talos_options': ['--xperf_path', 03:19:00 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 03:19:00 INFO - 'tests': ['tp5n']}}, 03:19:00 INFO - 'talos.zip': {'path': '', 03:19:00 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 03:19:00 INFO - Running post-action listener: _resource_record_post_action 03:19:00 INFO - [mozharness: 2016-11-24 11:19:00.562210Z] Finished populate-webroot step (success) 03:19:00 INFO - [mozharness: 2016-11-24 11:19:00.562299Z] Running create-virtualenv step. 03:19:00 INFO - Running pre-action listener: _resource_record_pre_action 03:19:00 INFO - Running main action method: create_virtualenv 03:19:00 INFO - Creating virtualenv /builds/slave/test/build/venv 03:19:00 INFO - Running command: ['/tools/buildbot/bin/python', '/tools/misc-python/virtualenv.py', '--no-site-packages', '--distribute', '/builds/slave/test/build/venv'] in /builds/slave/test/build 03:19:00 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 03:19:00 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 03:19:00 INFO - Using real prefix '/usr' 03:19:00 INFO - New python executable in /builds/slave/test/build/venv/bin/python 03:19:01 INFO - Installing distribute.............................................................................................................................................................................................done. 03:19:03 INFO - Installing pip.................done. 03:19:03 INFO - Return code: 0 03:19:03 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', '--version'] 03:19:03 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip --version 03:19:03 INFO - Reading from file tmpfile_stdout 03:19:03 INFO - Output received: 03:19:03 INFO - pip 1.5.5 from /builds/slave/test/build/venv/local/lib/python2.7/site-packages/pip-1.5.5-py2.7.egg (python 2.7) 03:19:03 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 03:19:03 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 03:19:03 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 03:19:03 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:19:03 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 03:19:03 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 03:19:03 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:19:03 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'pip>=1.5']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f37cd3e1e30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x130bb70>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x14a7130>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1535fc0>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1536ec0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1537350>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '934fc3100db09dcb9af4d4b6000001ab-1479977898.495261-576708901', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 03:19:03 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'pip>=1.5'] in /builds/slave/test/build 03:19:03 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub pip>=1.5 03:19:03 INFO - Using env: {'DISPLAY': ':0', 03:19:03 INFO - 'HOME': '/home/cltbld', 03:19:03 INFO - 'LANG': 'en_US.UTF-8', 03:19:03 INFO - 'LANGUAGE': 'en_US:en', 03:19:03 INFO - 'LOGNAME': 'cltbld', 03:19:03 INFO - 'MAIL': '/var/mail/cltbld', 03:19:03 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 03:19:03 INFO - 'MOZ_NO_REMOTE': '1', 03:19:03 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 03:19:03 INFO - 'NO_EM_RESTART': '1', 03:19:03 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 03:19:03 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 03:19:03 INFO - 'PWD': '/builds/slave/test', 03:19:03 INFO - 'SHELL': '/bin/bash', 03:19:03 INFO - 'SHLVL': '1', 03:19:03 INFO - 'TERM': 'linux', 03:19:03 INFO - 'TMOUT': '86400', 03:19:03 INFO - 'USER': 'cltbld', 03:19:03 INFO - 'XDG_SESSION_COOKIE': '934fc3100db09dcb9af4d4b6000001ab-1479977898.495261-576708901', 03:19:03 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 03:19:03 INFO - '_': '/tools/buildbot/bin/python'} 03:19:03 INFO - Ignoring indexes: https://pypi.python.org/simple/ 03:19:03 INFO - Requirement already satisfied (use --upgrade to upgrade): pip>=1.5 in ./venv/lib/python2.7/site-packages/pip-1.5.5-py2.7.egg 03:19:03 INFO - Cleaning up... 03:19:03 INFO - Return code: 0 03:19:03 INFO - Installing psutil>=3.1.1 into virtualenv /builds/slave/test/build/venv 03:19:03 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 03:19:03 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 03:19:03 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:19:03 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 03:19:03 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 03:19:03 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:19:03 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'psutil>=3.1.1']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f37cd3e1e30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x130bb70>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x14a7130>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1535fc0>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1536ec0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1537350>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '934fc3100db09dcb9af4d4b6000001ab-1479977898.495261-576708901', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 03:19:03 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'psutil>=3.1.1'] in /builds/slave/test/build 03:19:03 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub psutil>=3.1.1 03:19:03 INFO - Using env: {'DISPLAY': ':0', 03:19:03 INFO - 'HOME': '/home/cltbld', 03:19:03 INFO - 'LANG': 'en_US.UTF-8', 03:19:03 INFO - 'LANGUAGE': 'en_US:en', 03:19:03 INFO - 'LOGNAME': 'cltbld', 03:19:03 INFO - 'MAIL': '/var/mail/cltbld', 03:19:03 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 03:19:03 INFO - 'MOZ_NO_REMOTE': '1', 03:19:03 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 03:19:03 INFO - 'NO_EM_RESTART': '1', 03:19:03 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 03:19:03 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 03:19:03 INFO - 'PWD': '/builds/slave/test', 03:19:03 INFO - 'SHELL': '/bin/bash', 03:19:03 INFO - 'SHLVL': '1', 03:19:03 INFO - 'TERM': 'linux', 03:19:03 INFO - 'TMOUT': '86400', 03:19:03 INFO - 'USER': 'cltbld', 03:19:03 INFO - 'XDG_SESSION_COOKIE': '934fc3100db09dcb9af4d4b6000001ab-1479977898.495261-576708901', 03:19:03 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 03:19:03 INFO - '_': '/tools/buildbot/bin/python'} 03:19:03 INFO - Ignoring indexes: https://pypi.python.org/simple/ 03:19:03 INFO - Downloading/unpacking psutil>=3.1.1 03:19:03 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 03:19:03 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 03:19:03 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 03:19:03 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 03:19:03 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 03:19:03 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 03:19:05 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 03:19:05 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 03:19:05 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 03:19:05 INFO - Installing collected packages: psutil 03:19:05 INFO - Running setup.py install for psutil 03:19:05 INFO - building 'psutil._psutil_linux' extension 03:19:05 INFO - gcc -pthread -fno-strict-aliasing -DNDEBUG -g -fwrapv -O2 -Wall -Wstrict-prototypes -fPIC -DPSUTIL_VERSION=311 -I/usr/include/python2.7 -c psutil/_psutil_linux.c -o build/temp.linux-x86_64-2.7/psutil/_psutil_linux.o 03:19:06 INFO - gcc -pthread -shared -Wl,-O1 -Wl,-Bsymbolic-functions -Wl,-Bsymbolic-functions -Wl,-z,relro build/temp.linux-x86_64-2.7/psutil/_psutil_linux.o -o build/lib.linux-x86_64-2.7/psutil/_psutil_linux.so 03:19:06 INFO - building 'psutil._psutil_posix' extension 03:19:06 INFO - gcc -pthread -fno-strict-aliasing -DNDEBUG -g -fwrapv -O2 -Wall -Wstrict-prototypes -fPIC -I/usr/include/python2.7 -c psutil/_psutil_posix.c -o build/temp.linux-x86_64-2.7/psutil/_psutil_posix.o 03:19:06 INFO - gcc -pthread -shared -Wl,-O1 -Wl,-Bsymbolic-functions -Wl,-Bsymbolic-functions -Wl,-z,relro build/temp.linux-x86_64-2.7/psutil/_psutil_posix.o -o build/lib.linux-x86_64-2.7/psutil/_psutil_posix.so 03:19:06 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 03:19:06 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 03:19:06 INFO - Successfully installed psutil 03:19:06 INFO - Cleaning up... 03:19:06 INFO - Return code: 0 03:19:06 INFO - Installing mozsystemmonitor==0.3 into virtualenv /builds/slave/test/build/venv 03:19:06 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 03:19:06 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 03:19:06 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:19:06 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 03:19:06 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 03:19:06 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:19:06 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'mozsystemmonitor==0.3']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f37cd3e1e30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x130bb70>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x14a7130>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1535fc0>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1536ec0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1537350>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '934fc3100db09dcb9af4d4b6000001ab-1479977898.495261-576708901', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 03:19:06 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'mozsystemmonitor==0.3'] in /builds/slave/test/build 03:19:06 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub mozsystemmonitor==0.3 03:19:06 INFO - Using env: {'DISPLAY': ':0', 03:19:06 INFO - 'HOME': '/home/cltbld', 03:19:06 INFO - 'LANG': 'en_US.UTF-8', 03:19:06 INFO - 'LANGUAGE': 'en_US:en', 03:19:06 INFO - 'LOGNAME': 'cltbld', 03:19:06 INFO - 'MAIL': '/var/mail/cltbld', 03:19:06 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 03:19:06 INFO - 'MOZ_NO_REMOTE': '1', 03:19:06 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 03:19:06 INFO - 'NO_EM_RESTART': '1', 03:19:06 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 03:19:06 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 03:19:06 INFO - 'PWD': '/builds/slave/test', 03:19:06 INFO - 'SHELL': '/bin/bash', 03:19:06 INFO - 'SHLVL': '1', 03:19:06 INFO - 'TERM': 'linux', 03:19:06 INFO - 'TMOUT': '86400', 03:19:06 INFO - 'USER': 'cltbld', 03:19:06 INFO - 'XDG_SESSION_COOKIE': '934fc3100db09dcb9af4d4b6000001ab-1479977898.495261-576708901', 03:19:06 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 03:19:06 INFO - '_': '/tools/buildbot/bin/python'} 03:19:06 INFO - Ignoring indexes: https://pypi.python.org/simple/ 03:19:06 INFO - Downloading/unpacking mozsystemmonitor==0.3 03:19:06 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 03:19:06 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 03:19:06 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 03:19:06 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 03:19:06 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 03:19:06 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 03:19:08 INFO - Downloading mozsystemmonitor-0.3.tar.gz 03:19:08 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 03:19:08 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.3) 03:19:08 INFO - Installing collected packages: mozsystemmonitor 03:19:08 INFO - Running setup.py install for mozsystemmonitor 03:19:08 INFO - Successfully installed mozsystemmonitor 03:19:08 INFO - Cleaning up... 03:19:08 INFO - Return code: 0 03:19:08 INFO - Installing jsonschema==2.5.1 into virtualenv /builds/slave/test/build/venv 03:19:08 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 03:19:08 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 03:19:08 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:19:08 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 03:19:08 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 03:19:08 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:19:08 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema==2.5.1']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f37cd3e1e30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x130bb70>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x14a7130>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1535fc0>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1536ec0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1537350>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '934fc3100db09dcb9af4d4b6000001ab-1479977898.495261-576708901', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 03:19:08 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema==2.5.1'] in /builds/slave/test/build 03:19:08 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub jsonschema==2.5.1 03:19:08 INFO - Using env: {'DISPLAY': ':0', 03:19:08 INFO - 'HOME': '/home/cltbld', 03:19:08 INFO - 'LANG': 'en_US.UTF-8', 03:19:08 INFO - 'LANGUAGE': 'en_US:en', 03:19:08 INFO - 'LOGNAME': 'cltbld', 03:19:08 INFO - 'MAIL': '/var/mail/cltbld', 03:19:08 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 03:19:08 INFO - 'MOZ_NO_REMOTE': '1', 03:19:08 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 03:19:08 INFO - 'NO_EM_RESTART': '1', 03:19:08 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 03:19:08 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 03:19:08 INFO - 'PWD': '/builds/slave/test', 03:19:08 INFO - 'SHELL': '/bin/bash', 03:19:08 INFO - 'SHLVL': '1', 03:19:08 INFO - 'TERM': 'linux', 03:19:08 INFO - 'TMOUT': '86400', 03:19:08 INFO - 'USER': 'cltbld', 03:19:08 INFO - 'XDG_SESSION_COOKIE': '934fc3100db09dcb9af4d4b6000001ab-1479977898.495261-576708901', 03:19:08 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 03:19:08 INFO - '_': '/tools/buildbot/bin/python'} 03:19:08 INFO - Ignoring indexes: https://pypi.python.org/simple/ 03:19:08 INFO - Downloading/unpacking jsonschema==2.5.1 03:19:08 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 03:19:08 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 03:19:08 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 03:19:08 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 03:19:08 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 03:19:08 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 03:19:10 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 03:19:10 INFO - Downloading/unpacking functools32 (from jsonschema==2.5.1) 03:19:10 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 03:19:10 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 03:19:10 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 03:19:10 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 03:19:10 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 03:19:10 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 03:19:11 INFO - Downloading functools32-3.2.3-2.tar.gz 03:19:11 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/functools32/setup.py) egg_info for package functools32 03:19:11 INFO - warning: no files found matching '*.txt' 03:19:11 INFO - no previously-included directories found matching 'build' 03:19:11 INFO - no previously-included directories found matching 'dist' 03:19:11 INFO - no previously-included directories found matching '.git*' 03:19:11 INFO - Installing collected packages: jsonschema, functools32 03:19:11 INFO - Running setup.py install for functools32 03:19:11 INFO - warning: no files found matching '*.txt' 03:19:11 INFO - no previously-included directories found matching 'build' 03:19:11 INFO - no previously-included directories found matching 'dist' 03:19:11 INFO - no previously-included directories found matching '.git*' 03:19:11 INFO - Successfully installed jsonschema functools32 03:19:11 INFO - Cleaning up... 03:19:11 INFO - Return code: 0 03:19:11 INFO - Installing functools32==3.2.3-2 into virtualenv /builds/slave/test/build/venv 03:19:11 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 03:19:11 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 03:19:11 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:19:11 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 03:19:11 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 03:19:11 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:19:11 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'functools32==3.2.3-2']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f37cd3e1e30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x130bb70>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x14a7130>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1535fc0>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1536ec0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1537350>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '934fc3100db09dcb9af4d4b6000001ab-1479977898.495261-576708901', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 03:19:11 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'functools32==3.2.3-2'] in /builds/slave/test/build 03:19:11 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub functools32==3.2.3-2 03:19:11 INFO - Using env: {'DISPLAY': ':0', 03:19:11 INFO - 'HOME': '/home/cltbld', 03:19:11 INFO - 'LANG': 'en_US.UTF-8', 03:19:11 INFO - 'LANGUAGE': 'en_US:en', 03:19:11 INFO - 'LOGNAME': 'cltbld', 03:19:11 INFO - 'MAIL': '/var/mail/cltbld', 03:19:11 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 03:19:11 INFO - 'MOZ_NO_REMOTE': '1', 03:19:11 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 03:19:11 INFO - 'NO_EM_RESTART': '1', 03:19:11 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 03:19:11 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 03:19:11 INFO - 'PWD': '/builds/slave/test', 03:19:11 INFO - 'SHELL': '/bin/bash', 03:19:11 INFO - 'SHLVL': '1', 03:19:11 INFO - 'TERM': 'linux', 03:19:11 INFO - 'TMOUT': '86400', 03:19:11 INFO - 'USER': 'cltbld', 03:19:11 INFO - 'XDG_SESSION_COOKIE': '934fc3100db09dcb9af4d4b6000001ab-1479977898.495261-576708901', 03:19:11 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 03:19:11 INFO - '_': '/tools/buildbot/bin/python'} 03:19:11 INFO - Ignoring indexes: https://pypi.python.org/simple/ 03:19:11 INFO - Requirement already satisfied (use --upgrade to upgrade): functools32==3.2.3-2 in ./venv/lib/python2.7/site-packages 03:19:11 INFO - Cleaning up... 03:19:11 INFO - Return code: 0 03:19:11 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 03:19:11 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 03:19:11 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 03:19:11 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:19:11 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 03:19:11 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 03:19:11 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:19:11 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'blobuploader==1.2.4']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f37cd3e1e30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x130bb70>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x14a7130>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1535fc0>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1536ec0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1537350>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '934fc3100db09dcb9af4d4b6000001ab-1479977898.495261-576708901', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 03:19:11 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'blobuploader==1.2.4'] in /builds/slave/test/build 03:19:11 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub blobuploader==1.2.4 03:19:11 INFO - Using env: {'DISPLAY': ':0', 03:19:11 INFO - 'HOME': '/home/cltbld', 03:19:11 INFO - 'LANG': 'en_US.UTF-8', 03:19:11 INFO - 'LANGUAGE': 'en_US:en', 03:19:11 INFO - 'LOGNAME': 'cltbld', 03:19:11 INFO - 'MAIL': '/var/mail/cltbld', 03:19:11 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 03:19:11 INFO - 'MOZ_NO_REMOTE': '1', 03:19:11 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 03:19:11 INFO - 'NO_EM_RESTART': '1', 03:19:11 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 03:19:11 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 03:19:11 INFO - 'PWD': '/builds/slave/test', 03:19:11 INFO - 'SHELL': '/bin/bash', 03:19:11 INFO - 'SHLVL': '1', 03:19:11 INFO - 'TERM': 'linux', 03:19:11 INFO - 'TMOUT': '86400', 03:19:11 INFO - 'USER': 'cltbld', 03:19:11 INFO - 'XDG_SESSION_COOKIE': '934fc3100db09dcb9af4d4b6000001ab-1479977898.495261-576708901', 03:19:11 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 03:19:11 INFO - '_': '/tools/buildbot/bin/python'} 03:19:11 INFO - Ignoring indexes: https://pypi.python.org/simple/ 03:19:11 INFO - Downloading/unpacking blobuploader==1.2.4 03:19:11 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 03:19:11 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 03:19:11 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 03:19:11 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 03:19:11 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 03:19:11 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 03:19:13 INFO - Downloading blobuploader-1.2.4.tar.gz 03:19:13 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 03:19:13 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 03:19:13 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 03:19:13 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 03:19:13 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 03:19:13 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 03:19:13 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 03:19:13 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 03:19:14 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 03:19:14 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 03:19:14 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 03:19:14 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 03:19:14 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 03:19:14 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 03:19:14 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 03:19:14 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 03:19:14 INFO - Downloading docopt-0.6.1.tar.gz 03:19:14 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 03:19:14 INFO - Installing collected packages: blobuploader, requests, docopt 03:19:14 INFO - Running setup.py install for blobuploader 03:19:14 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 03:19:14 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 03:19:14 INFO - Running setup.py install for requests 03:19:15 INFO - Running setup.py install for docopt 03:19:15 INFO - Successfully installed blobuploader requests docopt 03:19:15 INFO - Cleaning up... 03:19:15 INFO - Return code: 0 03:19:15 INFO - Installing None into virtualenv /builds/slave/test/build/venv 03:19:15 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 03:19:15 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 03:19:15 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:19:15 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 03:19:15 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 03:19:15 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:19:15 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--no-deps', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f37cd3e1e30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x130bb70>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x14a7130>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1535fc0>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1536ec0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1537350>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build/tests/config', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '934fc3100db09dcb9af4d4b6000001ab-1479977898.495261-576708901', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 03:19:15 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--no-deps', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test/build/tests/config 03:19:15 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --no-deps --timeout 120 -r /builds/slave/test/build/tests/config/mozbase_requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 03:19:15 INFO - Using env: {'DISPLAY': ':0', 03:19:15 INFO - 'HOME': '/home/cltbld', 03:19:15 INFO - 'LANG': 'en_US.UTF-8', 03:19:15 INFO - 'LANGUAGE': 'en_US:en', 03:19:15 INFO - 'LOGNAME': 'cltbld', 03:19:15 INFO - 'MAIL': '/var/mail/cltbld', 03:19:15 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 03:19:15 INFO - 'MOZ_NO_REMOTE': '1', 03:19:15 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 03:19:15 INFO - 'NO_EM_RESTART': '1', 03:19:15 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 03:19:15 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 03:19:15 INFO - 'PWD': '/builds/slave/test', 03:19:15 INFO - 'SHELL': '/bin/bash', 03:19:15 INFO - 'SHLVL': '1', 03:19:15 INFO - 'TERM': 'linux', 03:19:15 INFO - 'TMOUT': '86400', 03:19:15 INFO - 'USER': 'cltbld', 03:19:15 INFO - 'XDG_SESSION_COOKIE': '934fc3100db09dcb9af4d4b6000001ab-1479977898.495261-576708901', 03:19:15 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 03:19:15 INFO - '_': '/tools/buildbot/bin/python'} 03:19:15 INFO - Ignoring indexes: https://pypi.python.org/simple/ 03:19:15 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 03:19:15 INFO - Running setup.py (path:/tmp/pip-sRfe28-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 03:19:15 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 03:19:15 INFO - Running setup.py (path:/tmp/pip-DFtRXg-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 03:19:15 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 03:19:15 INFO - Running setup.py (path:/tmp/pip-IfNQEb-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 03:19:15 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 03:19:15 INFO - Running setup.py (path:/tmp/pip-Y6HxEs-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 03:19:15 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 03:19:15 INFO - Running setup.py (path:/tmp/pip-vf91lO-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 03:19:15 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 03:19:15 INFO - Running setup.py (path:/tmp/pip-r33PQw-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 03:19:15 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 03:19:15 INFO - Running setup.py (path:/tmp/pip-y3Fs6r-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 03:19:15 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 03:19:15 INFO - Running setup.py (path:/tmp/pip-ZIlwgb-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 03:19:15 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 03:19:15 INFO - Running setup.py (path:/tmp/pip-pLPMPT-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 03:19:16 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 03:19:16 INFO - Running setup.py (path:/tmp/pip-y_30B9-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 03:19:16 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 03:19:16 INFO - Running setup.py (path:/tmp/pip-DCWVbZ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 03:19:16 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 03:19:16 INFO - Running setup.py (path:/tmp/pip-dlfozJ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 03:19:16 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 03:19:16 INFO - Running setup.py (path:/tmp/pip-chZLua-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 03:19:16 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 03:19:16 INFO - Running setup.py (path:/tmp/pip-FXZoZv-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 03:19:16 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 03:19:16 INFO - Running setup.py (path:/tmp/pip-JvecgQ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 03:19:16 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 03:19:16 INFO - Running setup.py (path:/tmp/pip-zv99rQ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 03:19:16 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 03:19:16 INFO - Running setup.py (path:/tmp/pip-HJwEfW-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 03:19:16 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 03:19:16 INFO - Running setup.py install for manifestparser 03:19:16 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 03:19:16 INFO - Running setup.py install for mozcrash 03:19:16 INFO - Running setup.py install for mozdebug 03:19:16 INFO - Running setup.py install for mozdevice 03:19:17 INFO - Installing sutini script to /builds/slave/test/build/venv/bin 03:19:17 INFO - Installing dm script to /builds/slave/test/build/venv/bin 03:19:17 INFO - Running setup.py install for mozfile 03:19:17 INFO - Running setup.py install for mozhttpd 03:19:17 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 03:19:17 INFO - Running setup.py install for mozinfo 03:19:17 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 03:19:17 INFO - Running setup.py install for mozInstall 03:19:17 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 03:19:17 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 03:19:17 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 03:19:17 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 03:19:17 INFO - Running setup.py install for mozleak 03:19:17 INFO - Running setup.py install for mozlog 03:19:17 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 03:19:17 INFO - Running setup.py install for moznetwork 03:19:17 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 03:19:17 INFO - Running setup.py install for mozprocess 03:19:17 INFO - Running setup.py install for mozprofile 03:19:18 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 03:19:18 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 03:19:18 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 03:19:18 INFO - Running setup.py install for mozrunner 03:19:18 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 03:19:18 INFO - Running setup.py install for mozscreenshot 03:19:18 INFO - Running setup.py install for moztest 03:19:18 INFO - Running setup.py install for mozversion 03:19:18 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 03:19:18 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 03:19:18 INFO - Cleaning up... 03:19:18 INFO - Return code: 0 03:19:18 INFO - Installing None into virtualenv /builds/slave/test/build/venv 03:19:18 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 03:19:18 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 03:19:18 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:19:18 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 03:19:18 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 03:19:18 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:19:18 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f37cd3e1e30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x130bb70>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x14a7130>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1535fc0>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1536ec0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1537350>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build/tests/config', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '934fc3100db09dcb9af4d4b6000001ab-1479977898.495261-576708901', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 03:19:18 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test/build/tests/config 03:19:18 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 -r /builds/slave/test/build/tests/config/mozbase_requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 03:19:18 INFO - Using env: {'DISPLAY': ':0', 03:19:18 INFO - 'HOME': '/home/cltbld', 03:19:18 INFO - 'LANG': 'en_US.UTF-8', 03:19:18 INFO - 'LANGUAGE': 'en_US:en', 03:19:18 INFO - 'LOGNAME': 'cltbld', 03:19:18 INFO - 'MAIL': '/var/mail/cltbld', 03:19:18 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 03:19:18 INFO - 'MOZ_NO_REMOTE': '1', 03:19:18 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 03:19:18 INFO - 'NO_EM_RESTART': '1', 03:19:18 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 03:19:18 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 03:19:18 INFO - 'PWD': '/builds/slave/test', 03:19:18 INFO - 'SHELL': '/bin/bash', 03:19:18 INFO - 'SHLVL': '1', 03:19:18 INFO - 'TERM': 'linux', 03:19:18 INFO - 'TMOUT': '86400', 03:19:18 INFO - 'USER': 'cltbld', 03:19:18 INFO - 'XDG_SESSION_COOKIE': '934fc3100db09dcb9af4d4b6000001ab-1479977898.495261-576708901', 03:19:18 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 03:19:18 INFO - '_': '/tools/buildbot/bin/python'} 03:19:18 INFO - Ignoring indexes: https://pypi.python.org/simple/ 03:19:18 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 03:19:18 INFO - Running setup.py (path:/tmp/pip-w_e6Dk-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 03:19:18 INFO - Requirement already satisfied (use --upgrade to upgrade): manifestparser==1.1 from file:///builds/slave/test/build/tests/mozbase/manifestparser in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 1)) 03:19:18 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 03:19:18 INFO - Running setup.py (path:/tmp/pip-47YLjr-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 03:19:18 INFO - Requirement already satisfied (use --upgrade to upgrade): mozcrash==1.0 from file:///builds/slave/test/build/tests/mozbase/mozcrash in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 03:19:18 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 03:19:18 INFO - Running setup.py (path:/tmp/pip-dVdXG0-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 03:19:18 INFO - Requirement already satisfied (use --upgrade to upgrade): mozdebug==0.1 from file:///builds/slave/test/build/tests/mozbase/mozdebug in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 3)) 03:19:18 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 03:19:18 INFO - Running setup.py (path:/tmp/pip-hxcZvJ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 03:19:19 INFO - Requirement already satisfied (use --upgrade to upgrade): mozdevice==0.49 from file:///builds/slave/test/build/tests/mozbase/mozdevice in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 03:19:19 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 03:19:19 INFO - Running setup.py (path:/tmp/pip-6LrZWb-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 03:19:19 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile==1.2 from file:///builds/slave/test/build/tests/mozbase/mozfile in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 5)) 03:19:19 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 03:19:19 INFO - Running setup.py (path:/tmp/pip-tOLcfY-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 03:19:19 INFO - Requirement already satisfied (use --upgrade to upgrade): mozhttpd==0.7 from file:///builds/slave/test/build/tests/mozbase/mozhttpd in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 6)) 03:19:19 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 03:19:19 INFO - Running setup.py (path:/tmp/pip-uKpDe4-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 03:19:19 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo==0.9 from file:///builds/slave/test/build/tests/mozbase/mozinfo in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 7)) 03:19:19 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 03:19:19 INFO - Running setup.py (path:/tmp/pip-WoGjGT-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 03:19:19 INFO - Requirement already satisfied (use --upgrade to upgrade): mozInstall==1.12 from file:///builds/slave/test/build/tests/mozbase/mozinstall in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 8)) 03:19:19 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 03:19:19 INFO - Running setup.py (path:/tmp/pip-gQlgJk-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 03:19:19 INFO - Requirement already satisfied (use --upgrade to upgrade): mozleak==0.1 from file:///builds/slave/test/build/tests/mozbase/mozleak in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 9)) 03:19:19 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 03:19:19 INFO - Running setup.py (path:/tmp/pip-Jqnvls-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 03:19:19 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog==3.4 from file:///builds/slave/test/build/tests/mozbase/mozlog in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 03:19:19 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 03:19:19 INFO - Running setup.py (path:/tmp/pip-qhwh4o-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 03:19:19 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork==0.27 from file:///builds/slave/test/build/tests/mozbase/moznetwork in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 11)) 03:19:19 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 03:19:19 INFO - Running setup.py (path:/tmp/pip-gQLExB-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 03:19:19 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess==0.23 from file:///builds/slave/test/build/tests/mozbase/mozprocess in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 12)) 03:19:19 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 03:19:19 INFO - Running setup.py (path:/tmp/pip-bBoUXy-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 03:19:19 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprofile==0.28 from file:///builds/slave/test/build/tests/mozbase/mozprofile in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 13)) 03:19:19 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 03:19:19 INFO - Running setup.py (path:/tmp/pip-KfFigK-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 03:19:19 INFO - Requirement already satisfied (use --upgrade to upgrade): mozrunner==6.13 from file:///builds/slave/test/build/tests/mozbase/mozrunner in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 14)) 03:19:19 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 03:19:19 INFO - Running setup.py (path:/tmp/pip-D0Bh5a-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 03:19:19 INFO - Requirement already satisfied (use --upgrade to upgrade): mozscreenshot==0.1 from file:///builds/slave/test/build/tests/mozbase/mozscreenshot in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 15)) 03:19:19 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 03:19:19 INFO - Running setup.py (path:/tmp/pip-vOdIyq-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 03:19:19 INFO - Requirement already satisfied (use --upgrade to upgrade): moztest==0.7 from file:///builds/slave/test/build/tests/mozbase/moztest in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 16)) 03:19:19 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 03:19:19 INFO - Running setup.py (path:/tmp/pip-82TdJG-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 03:19:19 INFO - Requirement already satisfied (use --upgrade to upgrade): mozversion==1.4 from file:///builds/slave/test/build/tests/mozbase/mozversion in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 17)) 03:19:19 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile>=1.0 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozcrash==1.0->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 03:19:19 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog>=3.0 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozcrash==1.0->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 03:19:19 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozdebug==0.1->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 3)) 03:19:19 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork>=0.24 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozdevice==0.49->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 03:19:19 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess>=0.19 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozdevice==0.49->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 03:19:20 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.4->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 03:19:20 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 03:19:20 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 03:19:20 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 03:19:20 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 03:19:20 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 03:19:20 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 03:19:21 INFO - Downloading blessings-1.6.tar.gz 03:19:21 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 03:19:22 INFO - Installing collected packages: blessings 03:19:22 INFO - Running setup.py install for blessings 03:19:22 INFO - Successfully installed blessings 03:19:22 INFO - Cleaning up... 03:19:22 INFO - Return code: 0 03:19:22 INFO - Done creating virtualenv /builds/slave/test/build/venv. 03:19:22 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 03:19:22 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 03:19:22 INFO - Reading from file tmpfile_stdout 03:19:22 INFO - Current package versions: 03:19:22 INFO - argparse == 1.2.1 03:19:22 INFO - blessings == 1.6 03:19:22 INFO - blobuploader == 1.2.4 03:19:22 INFO - docopt == 0.6.1 03:19:22 INFO - functools32 == 3.2.3-2 03:19:22 INFO - jsonschema == 2.5.1 03:19:22 INFO - manifestparser == 1.1 03:19:22 INFO - mozInstall == 1.12 03:19:22 INFO - mozcrash == 1.0 03:19:22 INFO - mozdebug == 0.1 03:19:22 INFO - mozdevice == 0.49 03:19:22 INFO - mozfile == 1.2 03:19:22 INFO - mozhttpd == 0.7 03:19:22 INFO - mozinfo == 0.9 03:19:22 INFO - mozleak == 0.1 03:19:22 INFO - mozlog == 3.4 03:19:22 INFO - moznetwork == 0.27 03:19:22 INFO - mozprocess == 0.23 03:19:22 INFO - mozprofile == 0.28 03:19:22 INFO - mozrunner == 6.13 03:19:22 INFO - mozscreenshot == 0.1 03:19:22 INFO - mozsystemmonitor == 0.3 03:19:22 INFO - moztest == 0.7 03:19:22 INFO - mozversion == 1.4 03:19:22 INFO - psutil == 3.1.1 03:19:22 INFO - requests == 1.2.3 03:19:22 INFO - wsgiref == 0.1.2 03:19:22 INFO - Installing None into virtualenv /builds/slave/test/build/venv 03:19:22 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 03:19:22 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 03:19:22 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:19:22 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 03:19:22 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 03:19:22 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:19:22 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test/build/tests/talos/requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f37cd3e1e30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x130bb70>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x14a7130>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1535fc0>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1536ec0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1537350>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build/tests/talos', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '934fc3100db09dcb9af4d4b6000001ab-1479977898.495261-576708901', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 03:19:22 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test/build/tests/talos/requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test/build/tests/talos 03:19:22 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 -r /builds/slave/test/build/tests/talos/requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 03:19:22 INFO - Using env: {'DISPLAY': ':0', 03:19:22 INFO - 'HOME': '/home/cltbld', 03:19:22 INFO - 'LANG': 'en_US.UTF-8', 03:19:22 INFO - 'LANGUAGE': 'en_US:en', 03:19:22 INFO - 'LOGNAME': 'cltbld', 03:19:22 INFO - 'MAIL': '/var/mail/cltbld', 03:19:22 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 03:19:22 INFO - 'MOZ_NO_REMOTE': '1', 03:19:22 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 03:19:22 INFO - 'NO_EM_RESTART': '1', 03:19:22 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 03:19:22 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 03:19:22 INFO - 'PWD': '/builds/slave/test', 03:19:22 INFO - 'SHELL': '/bin/bash', 03:19:22 INFO - 'SHLVL': '1', 03:19:22 INFO - 'TERM': 'linux', 03:19:22 INFO - 'TMOUT': '86400', 03:19:22 INFO - 'USER': 'cltbld', 03:19:22 INFO - 'XDG_SESSION_COOKIE': '934fc3100db09dcb9af4d4b6000001ab-1479977898.495261-576708901', 03:19:22 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 03:19:22 INFO - '_': '/tools/buildbot/bin/python'} 03:19:22 INFO - Ignoring indexes: https://pypi.python.org/simple/ 03:19:22 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog>=3.1 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 1)) 03:19:22 INFO - Requirement already satisfied (use --upgrade to upgrade): mozcrash>=0.15 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 2)) 03:19:22 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile>=1.2 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 3)) 03:19:22 INFO - Requirement already satisfied (use --upgrade to upgrade): mozhttpd>=0.7 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 4)) 03:19:22 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo>=0.8 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 5)) 03:19:22 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess>=0.22 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 6)) 03:19:22 INFO - Requirement already satisfied (use --upgrade to upgrade): mozversion>=1.3 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 7)) 03:19:22 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprofile>=0.25 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 8)) 03:19:22 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 9)) 03:19:22 INFO - Requirement already satisfied (use --upgrade to upgrade): blessings>=1.3 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozlog>=3.1->-r /builds/slave/test/build/tests/talos/requirements.txt (line 1)) 03:19:22 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork>=0.24 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozhttpd>=0.7->-r /builds/slave/test/build/tests/talos/requirements.txt (line 4)) 03:19:22 INFO - Cleaning up... 03:19:22 INFO - Return code: 0 03:19:22 INFO - Installing jsonschema into virtualenv /builds/slave/test/build/venv 03:19:22 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 03:19:22 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 03:19:22 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:19:22 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 03:19:22 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 03:19:22 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:19:22 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f37cd3e1e30>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x130bb70>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x14a7130>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1535fc0>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1536ec0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1537350>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '934fc3100db09dcb9af4d4b6000001ab-1479977898.495261-576708901', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 03:19:22 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema'] in /builds/slave/test/build 03:19:22 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub jsonschema 03:19:22 INFO - Using env: {'DISPLAY': ':0', 03:19:22 INFO - 'HOME': '/home/cltbld', 03:19:22 INFO - 'LANG': 'en_US.UTF-8', 03:19:22 INFO - 'LANGUAGE': 'en_US:en', 03:19:22 INFO - 'LOGNAME': 'cltbld', 03:19:22 INFO - 'MAIL': '/var/mail/cltbld', 03:19:22 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 03:19:22 INFO - 'MOZ_NO_REMOTE': '1', 03:19:22 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 03:19:22 INFO - 'NO_EM_RESTART': '1', 03:19:22 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 03:19:22 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 03:19:22 INFO - 'PWD': '/builds/slave/test', 03:19:22 INFO - 'SHELL': '/bin/bash', 03:19:22 INFO - 'SHLVL': '1', 03:19:22 INFO - 'TERM': 'linux', 03:19:22 INFO - 'TMOUT': '86400', 03:19:22 INFO - 'USER': 'cltbld', 03:19:22 INFO - 'XDG_SESSION_COOKIE': '934fc3100db09dcb9af4d4b6000001ab-1479977898.495261-576708901', 03:19:22 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 03:19:22 INFO - '_': '/tools/buildbot/bin/python'} 03:19:22 INFO - Ignoring indexes: https://pypi.python.org/simple/ 03:19:22 INFO - Requirement already satisfied (use --upgrade to upgrade): jsonschema in ./venv/lib/python2.7/site-packages 03:19:22 INFO - Cleaning up... 03:19:22 INFO - Return code: 0 03:19:22 INFO - Running post-action listener: _resource_record_post_action 03:19:22 INFO - Running post-action listener: _start_resource_monitoring 03:19:22 INFO - Starting resource monitoring. 03:19:22 INFO - [mozharness: 2016-11-24 11:19:22.923014Z] Finished create-virtualenv step (success) 03:19:22 INFO - [mozharness: 2016-11-24 11:19:22.923534Z] Running install step. 03:19:22 INFO - Running pre-action listener: _resource_record_pre_action 03:19:22 INFO - Running main action method: install 03:19:22 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 03:19:22 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 03:19:23 INFO - Reading from file tmpfile_stdout 03:19:23 INFO - Detecting whether we're running mozinstall >=1.0... 03:19:23 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 03:19:23 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 03:19:23 INFO - Reading from file tmpfile_stdout 03:19:23 INFO - Output received: 03:19:23 INFO - Usage: mozinstall [options] installer 03:19:23 INFO - Options: 03:19:23 INFO - -h, --help show this help message and exit 03:19:23 INFO - -d DEST, --destination=DEST 03:19:23 INFO - Directory to install application into. [default: 03:19:23 INFO - "/builds/slave/test"] 03:19:23 INFO - --app=APP Application being installed. [default: firefox] 03:19:23 INFO - mkdir: /builds/slave/test/build/application 03:19:23 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '/builds/slave/test/build/firefox-53.0a1.en-US.linux-x86_64.tar.bz2', '--destination', '/builds/slave/test/build/application'] 03:19:23 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall /builds/slave/test/build/firefox-53.0a1.en-US.linux-x86_64.tar.bz2 --destination /builds/slave/test/build/application 03:19:40 INFO - Reading from file tmpfile_stdout 03:19:40 INFO - Output received: 03:19:40 INFO - /builds/slave/test/build/application/firefox/firefox 03:19:40 INFO - Running post-action listener: _resource_record_post_action 03:19:40 INFO - [mozharness: 2016-11-24 11:19:40.167992Z] Finished install step (success) 03:19:40 INFO - [mozharness: 2016-11-24 11:19:40.168267Z] Running run-tests step. 03:19:40 INFO - Running pre-action listener: _resource_record_pre_action 03:19:40 INFO - Running main action method: run_tests 03:19:40 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 03:19:40 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 03:19:40 INFO - Python 2.7.3 03:19:40 INFO - Return code: 0 03:19:40 INFO - grabbing minidump binary from tooltool 03:19:40 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 03:19:40 INFO - retry: Calling run_command with args: (['/tools/tooltool.py', '--url', 'https://api.pub.build.mozilla.org/tooltool/', '--authentication-file', '/builds/relengapi.tok', 'fetch', '-m', '/builds/slave/test/build/tests/config/tooltool-manifests/linux64/releng.manifest', '-o', '-c', '/builds/tooltool_cache'],), kwargs: {'output_timeout': 600, 'error_list': [{'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1535fc0>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1536ec0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1537350>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 03:19:40 INFO - Running command: ['/tools/tooltool.py', '--url', 'https://api.pub.build.mozilla.org/tooltool/', '--authentication-file', '/builds/relengapi.tok', 'fetch', '-m', '/builds/slave/test/build/tests/config/tooltool-manifests/linux64/releng.manifest', '-o', '-c', '/builds/tooltool_cache'] in /builds/slave/test/build 03:19:40 INFO - Copy/paste: /tools/tooltool.py --url https://api.pub.build.mozilla.org/tooltool/ --authentication-file /builds/relengapi.tok fetch -m /builds/slave/test/build/tests/config/tooltool-manifests/linux64/releng.manifest -o -c /builds/tooltool_cache 03:19:40 INFO - Calling ['/tools/tooltool.py', '--url', 'https://api.pub.build.mozilla.org/tooltool/', '--authentication-file', '/builds/relengapi.tok', 'fetch', '-m', '/builds/slave/test/build/tests/config/tooltool-manifests/linux64/releng.manifest', '-o', '-c', '/builds/tooltool_cache'] with output_timeout 600 03:19:40 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 03:19:40 INFO - Return code: 0 03:19:40 INFO - Chmoding /builds/slave/test/build/linux64-minidump_stackwalk to 0755 03:19:40 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 03:19:40 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 03:19:40 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/linux64-minidump_stackwalk 03:19:40 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 03:19:40 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Mozilla-Inbound', '--suite', 'dromaeojs', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://archive.mozilla.org/pub/firefox/tinderbox-builds/mozilla-inbound-linux64-pgo/1479976410/firefox-53.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-057', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log'] in /builds/slave/test/build 03:19:40 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/tests/talos/talos/run_tests.py --branchName Mozilla-Inbound --suite dromaeojs --executablePath /builds/slave/test/build/application/firefox/firefox --symbolsPath https://archive.mozilla.org/pub/firefox/tinderbox-builds/mozilla-inbound-linux64-pgo/1479976410/firefox-53.0a1.en-US.linux-x86_64.crashreporter-symbols.zip --title talos-linux64-ix-057 --webServer localhost --log-tbpl-level=debug --log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log --log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log 03:19:40 INFO - Using env: {'DISPLAY': ':0', 03:19:40 INFO - 'HOME': '/home/cltbld', 03:19:40 INFO - 'LANG': 'en_US.UTF-8', 03:19:40 INFO - 'LANGUAGE': 'en_US:en', 03:19:40 INFO - 'LOGNAME': 'cltbld', 03:19:40 INFO - 'MAIL': '/var/mail/cltbld', 03:19:40 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 03:19:40 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/linux64-minidump_stackwalk', 03:19:40 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 03:19:40 INFO - 'MOZ_NO_REMOTE': '1', 03:19:40 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 03:19:40 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 03:19:40 INFO - 'NO_EM_RESTART': '1', 03:19:40 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 03:19:40 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 03:19:40 INFO - 'PWD': '/builds/slave/test', 03:19:40 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 03:19:40 INFO - 'SHELL': '/bin/bash', 03:19:40 INFO - 'SHLVL': '1', 03:19:40 INFO - 'TERM': 'linux', 03:19:40 INFO - 'TMOUT': '86400', 03:19:40 INFO - 'USER': 'cltbld', 03:19:40 INFO - 'XDG_SESSION_COOKIE': '934fc3100db09dcb9af4d4b6000001ab-1479977898.495261-576708901', 03:19:40 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 03:19:40 INFO - '_': '/tools/buildbot/bin/python'} 03:19:40 INFO - Calling ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Mozilla-Inbound', '--suite', 'dromaeojs', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://archive.mozilla.org/pub/firefox/tinderbox-builds/mozilla-inbound-linux64-pgo/1479976410/firefox-53.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-057', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log'] with output_timeout 3600 03:19:40 INFO - mozversion application_buildid: 20161124003330 03:19:40 INFO - mozversion application_changeset: f9e3af2b0e9913d87e031ec993bd25a41d82cafb 03:19:40 INFO - mozversion application_display_name: Nightly 03:19:40 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 03:19:40 INFO - mozversion application_name: Firefox 03:19:40 INFO - mozversion application_remotingname: firefox 03:19:40 INFO - mozversion application_repository: https://hg.mozilla.org/integration/mozilla-inbound 03:19:40 INFO - mozversion application_vendor: Mozilla 03:19:40 INFO - mozversion application_version: 53.0a1 03:19:40 INFO - mozversion platform_buildid: 20161124003330 03:19:40 INFO - mozversion platform_changeset: f9e3af2b0e9913d87e031ec993bd25a41d82cafb 03:19:40 INFO - mozversion platform_repository: https://hg.mozilla.org/integration/mozilla-inbound 03:19:40 INFO - mozversion platform_version: 53.0a1 03:19:40 INFO - using testdate: 1479986380 03:19:40 INFO - actual date: 1479986380 03:19:40 INFO - starting webserver on 'localhost:49144' 03:19:40 INFO - SUITE-START | Running 2 tests 03:19:40 INFO - TEST-START | dromaeo_css 03:19:40 INFO - operating with platform_type : linux_ 03:19:40 INFO - Initialising browser for dromaeo_css test... 03:19:40 INFO - TEST-INFO | started process 6253 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpFsreDi/profile http://localhost:49144/getInfo.html) 03:19:44 INFO - PROCESS | 6253 | __metrics Screen width/height:1600/1200 03:19:44 INFO - PROCESS | 6253 | colorDepth:24 03:19:44 INFO - PROCESS | 6253 | Browser inner width/height: 1024/697 03:19:44 INFO - PROCESS | 6253 | __metrics 03:19:45 INFO - PROCESS | 6253 | JavaScript error: resource://gre/modules/AsyncShutdown.jsm, line 692: Error: Phase "quit-application-granted" is finished, it is too late to register completion condition "SessionStore: flushing all windows" 03:19:45 INFO - PROCESS | 6253 | JavaScript error: resource://app/modules/BrowserUsageTelemetry.jsm, line 211: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 03:19:46 INFO - PROCESS | 6253 | console.error: PushService: 03:19:46 INFO - PROCESS | 6253 | stateChangeProcessEnqueue: Error transitioning state 03:19:46 INFO - PROCESS | 6253 | UnknownError 03:19:46 INFO - TEST-INFO | 6253: exit 0 03:19:46 INFO - Browser initialized. 03:19:46 INFO - Running cycle 1/1 for dromaeo_css test... 03:19:46 INFO - TEST-INFO | started process 6334 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpFsreDi/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 03:19:58 INFO - PROCESS | 6334 | RSS: Main: 173674496 03:19:58 INFO - PROCESS | 6334 | 03:20:50 INFO - PROCESS | 6334 | 1479986450440 addons.productaddons ERROR Request failed certificate checks: [Exception... "SSL is required and URI scheme is not https." nsresult: "0x8000ffff (NS_ERROR_UNEXPECTED)" location: "JS frame :: resource://gre/modules/CertUtils.jsm :: checkCert :: line 145" data: no] 03:23:01 INFO - PROCESS | 6334 | Cycle 1(1): loaded http://localhost:49144/tests/dromaeo/cssquery-dojo.html (next: http://localhost:49144/tests/dromaeo/cssquery-ext.html) 03:23:02 INFO - PROCESS | 6334 | RSS: Main: 304541696 03:23:02 INFO - PROCESS | 6334 | 03:26:04 INFO - PROCESS | 6334 | Cycle 1(1): loaded http://localhost:49144/tests/dromaeo/cssquery-ext.html (next: http://localhost:49144/tests/dromaeo/cssquery-jquery.html) 03:26:05 INFO - PROCESS | 6334 | RSS: Main: 276221952 03:26:05 INFO - PROCESS | 6334 | 03:29:07 INFO - PROCESS | 6334 | Cycle 1(1): loaded http://localhost:49144/tests/dromaeo/cssquery-jquery.html (next: http://localhost:49144/tests/dromaeo/cssquery-mootools.html) 03:29:08 INFO - PROCESS | 6334 | RSS: Main: 255500288 03:29:08 INFO - PROCESS | 6334 | 03:32:10 INFO - PROCESS | 6334 | Cycle 1(1): loaded http://localhost:49144/tests/dromaeo/cssquery-mootools.html (next: http://localhost:49144/tests/dromaeo/cssquery-prototype.html) 03:32:11 INFO - PROCESS | 6334 | RSS: Main: 215257088 03:32:11 INFO - PROCESS | 6334 | 03:35:13 INFO - PROCESS | 6334 | Cycle 1(1): loaded http://localhost:49144/tests/dromaeo/cssquery-prototype.html (next: http://localhost:49144/tests/dromaeo/cssquery-yui.html) 03:35:14 INFO - PROCESS | 6334 | RSS: Main: 216002560 03:35:14 INFO - PROCESS | 6334 | 03:38:17 INFO - PROCESS | 6334 | Cycle 1(1): loaded http://localhost:49144/tests/dromaeo/cssquery-yui.html (next: http://localhost:49144/tests/dromaeo/cssquery-dojo.html) 03:38:17 INFO - PROCESS | 6334 | RSS: Main: 308252672 03:38:17 INFO - PROCESS | 6334 | 03:38:17 INFO - PROCESS | 6334 | __start_tp_report 03:38:17 INFO - PROCESS | 6334 | _x_x_mozilla_page_load 03:38:17 INFO - PROCESS | 6334 | _x_x_mozilla_page_load_details 03:38:17 INFO - PROCESS | 6334 | |i|pagename|runs| 03:38:17 INFO - PROCESS | 6334 | |0;dojo.html;3014.698530146985;3056.3734434440944;3075.5232938894474;3085.1207405889313;3086.2747254395213;5300.92048619271;5347.866303342418;5392.325959255093;5438.7824487020525;5475.479829416209;5393.622446428752;5404.351477822657;5407.297051383324;5413.052715774744;5421.891562168754;4847.3940757405235;4899.48555401683;4900.534449227318;4905.4358748744;4982.451930287665;4916.631252656047;4926.679765815228;4947.406311242656;4976.253561965698;5024.321716568272;753.1204621308456;4967.776450059756;4985;4987.102321582114;5031.069252188357;4353.673474489426;4940.382452193476;4962.801487940478;4968.850934471971;5033.345665063555;4935.753212339405;4936.432310284327;4936.851894443173;4940.456549779521;4982.57648099912;5401.378841433247;5404.216388623667;5420.674759514442;5444.292242008513;5448.45515448456;5538.169274608801;5625.634333768333;5633.887322253532;5676.716164191816;5687.061634830248;5767.538596912279;5781.855453613652;5793.275840519935;5826;5842.444967728059;5368.436314187033;5378.515933565959;5387.057264978652;5388.5419739321815;5421.891562168735;5748.626339287933;5793.710314484259;5809.448102430262;5871.4715675589405;5892.646441213541;5637.49262566371;5645.491905728422;5684.062129748628;5759.424057594207;5778.3354914184565;5693.914591281134;5797.420257974169;5802.274715660543;5804.65172089676;5804.767809287666;5783.161441590946;5783.913241301384;5784.94215057844;5805.535557155417;5808.128780682931;5581.860453488614;5599.944000559943;5643.802466913638;5712.285964254468;5772.365039845614;4436.290193569013;4436.534163912807;4455.77721113943;4476.2837945928495;4477.015056687524;3940.9014774630864;3944.9408258876138;3957.3866050762176;3974.960250397517;3981.1838573092446;5345.251664766935;5356.7321633918145;5507.889842203133;5512.5589952803675;5516.9448305517235;5694.772209111589;5712.571557133231;5717.571182161355;5749.993751093625;5804.042333015005;5400.91898621521;5430.83707488776;5443.374011988672;5446.400895901447;5448.291722076105;4897.559219670246;4975.502449754996;4980.178270585313;4986.950130498649;5028.019536190408;5834.095715164156;5906.852328691817;5949.464548190684;5953.732082056318;6039.335673076046;5789.1895134680335;5790.826275211751;5797.275340582427;5798.507126894261;5802.4197580241635;5885.911711324419;5940.049592065248;5947.613405128653;5950.761969521343;5953.7916172935475;5525.972370138124;5572.052751032254;5654.06707893193;5684.204211410323;5696.1455781633085;5788.82633520995;5840.8247752567495;5843.590948633555;5845.503132233808;5880.26496687914;5601.103823388238;5639;5639.689817060101;5642.407547207484;5646.407127251579;5502.724863756716;5554.472325129106;5557.277553917965;5585.441455854545;5624.85937851557;5597.860053498695;5602.411746766531;5613.438656134517;5645.040343141593;5651.660900345993;5536.833894983157;5643.125315576092;5689.089745640677;5694.772209111755;5696.601237913306;5448.509634132947;5533.5849811263515;5534.252875861707;5540.972295138498;5564.165375193753 03:38:17 INFO - PROCESS | 6334 | |1;ext.html;538.1527260169504;596.3708287756417;607.2075940897129;618.7865186510655;641.67595364341;31696;41976.58023419765;42571;42656.57343426565;42755.358669619905;42854.7857260714;43240.78379608106;43261;43290;43358.783206084;7859.724909628164;8042.638081286327;8503.277221436185;8646.913530864706;8653.567321633924;9858.16205622523;10093.899061009406;10098.040686134806;10404.739881502946;10415.947920260389;10243.897561024407;10300.742481437948;10303.433311167882;10315.896841031607;10318.484075796217;10177.338472999269;10223.591056357736;10223.642172523925;10225.795484090277;10233.334833235853;10110.039546243095;10161.847572286422;10170.135538479239;10171.338862973884;10173.03356181169;40883.182336353406;41077.79461102705;41205.79397103025;41255.7937210312;41299.793501032604;3386.3565922474895;3516.929661406783;3583.8566457341676;3812.4281357796276;3870.3226935286493;28681;28797.42405151906;28805.711942880513;30386;32591.674083259102;4104.630583247492;4170.35359519275;4232.894177645553;4346.15250026245;4369.104333611602;341808;344820;345888.2705586481;346583;350492;56277.43722562804;56808.71595642078;57004.71497642568;57269;57353;59476;59549.40450595525;59579;59599;59602;15479.226038698245;15831.366745330288;15937.442189523312;16021.519354419386;16044.598885027968;11356.318620882774;11382.317060976367;11594.942025289989;11789.646310610695;12369.505219791108;16457.506274811774;16491;16788.916055419646;16800.15999200035;16801.327946882233;6487.286398496161;6516.380943810331;6600.438962688129;6702.7381864114905;6804.6257455840405;918.7243826851918;972.8346181149221;1003.9196864250843;1027.2603725317758;1039.3192458939407;29987;30242.697573023986;30247;30780.384392312477;30808.845955770077;1058.1851973979992;1071.3433073372605;1089.5859573362072;1098.6868742408535;1132.6602019394313;15232.543023709306;16067.678646427006;16115.919420402823;16206.918965405097;16451.177441127897;448891;449549;454248;454697;455650;56143.71928140333;56404.435955640736;56469.71765141148;56776.43223567794;56871;1227.1900545639835;1246.214884622682;1288.7615791078492;1339.189790176929;1361.877431031212;27123;31346.52980205253;31620.36759264848;31963.520547192275;32121.35757284888;48992.755036226015;49457.752711237656;49475;49501.75249123731;49607.503924960285;361182;361423;362292.82803790347;363006;363169;27060.1881943542;27592.448151037268;27848.025319113734;29376.26559336034;39729.60270397259;46584.301235480816;46732.766336168104;46879.53120468888;47189.764051179525;48063.75968120137;38598.22803543969;38832.20436423671;39066.609333907436;40200.39699404453;40717.59282407138;38897.80551097226;39140.21719565536;39598.40602391024;39789.20421591494;40678;38591.03522411962;40423.1915361697;41467.58532414637;41571.792141040314;41753.58246417497;31259.53110703296;35198.648013520564;35279.29441411209;35978.8201058993;35996.82001589975;26755.19734407971;27051.86474067617;27254.591181132695;27389.31526711848;27585 03:38:17 INFO - PROCESS | 6334 | |2;jquery.html;373.9345614517462;391.1531534228396;395.2431094454121;399.6722687396335;419.4358587699545;13311.933440332798;15310.923445382772;16781.58046048848;18625.44123676292;19347.903260483712;18417.723734143965;18504.814951850476;19019.809801901978;19022.809771902277;19034.428967131007;5418.322709661293;5664.26364572605;5665.1785491103765;5665.915011274834;5669.0646043402785;3839.6352346527037;4011.2779699654197;5476;5512.614117011811;5756.539476841864;5711.314642242936;5756.222909907172;5794.39158888317;5799.246098007253;5805;5616.438356164392;5701.971490142564;5735.541156707495;5747.655140691572;5813.505852002585;5567.164925261202;5571.4428557144365;5573.191887176336;5575.303087114111;5595.832125036255;13387;17192.57018574533;19614.607707845764;22223.333300001024;22462.663060054114;2264.682944387787;2291.9083236670513;2464.6179842124498;2547.8726063696927;2645.6957449893125;8186.140455252173;9171.58727857248;9663.71008869728;10108.94945525275;10191.643292484727;1825.6896327624204;1872.4757068020976;1885.7359969604267;1895.5545446819986;2002.6181934465174;68945.65527172382;74433.25566744317;77375.6131219346;78878;79113.20886791173;10678.252522323362;10695.35827850316;10696.197785166143;10983.39591322485;11100.833487497694;15376.923115384352;15387.61530961735;15394.846051539565;15397.692046159014;15402.768958465633;7683;7824.178461261599;7853.960730196312;8017.478863873829;8021.074942013991;7416.22129676387;7417.554946703215;7428.625704244732;7620.8475830484185;7634.312911837961;4393.297072468454;4547.931781023287;4575.24508456101;4585.151746926829;4746.833860814855;1812.2479171143827;1875.0999520230093;1943.8542109341856;1994.9401517954484;2019.5657933544358;840.8402403543307;909.8308673354708;937.5312343828086;991.8809742830906;993.0913214408879;17728.37950671746;18931;19022.429327120208;19138.617227655646;19372.2251109954;907.4827348411474;948.2556193388157;964.7298756348234;1012.71643939697;1015.081351377005;10384.948075259575;10658.369831749402;10661.733456663645;10679.765961039882;10793.136549076213;410922;419061;420715;421348;421957;51980.74009630003;70909.64545177344;70939;86957;88094.55952720196;948.6679662118204;980.6420656460341;985.3890587835444;995.7361299255703;1000.4547521600745;12525.624231273076;16125.758113628539;17181.91409042947;17192.140392980553;17512.211950462515;38474.45934191138;39505.209895801345;39858;40466.1906761869;40484;48937.265941011625;51076.23385649144;55160;57381;57432.42567574271;7574.545527268161;7795.844083118192;7859.410544209093;7967.681292748225;8127.187281271826;11273.323600583992;12110.091743119125;12388.876111238773;12401.069919756235;12771.489140434278;10751.946240269062;10778.946105269424;10834.187435942178;11099.50052247667;11516.82724759146;10874.184436167478;11105.888941110808;11144.442777861237;11221.326720396803;11750.059995200534;11065.778684426105;11207.775844483227;11280.153988451064;11319.490622921823;11400.543978241109;7768.728094516665;7940.960295198487;7983.800404989689;8182.549959752271;8524.616392262238;9631;11203.271787333797;11320.37737924422;11482.253653512495;11897.345645989553 03:38:17 INFO - PROCESS | 6334 | |3;mootools.html;1447.3993292783491;1467.919264440456;1580.2888700084964;1674.631581052168;1740.3647668600966;7534.510256833302;7710.421718371131;8004.439689221749;8607.569621518922;8611.354148438877;7965.800854978628;8303.75088747337;8315.293200077986;8504.19210175034;8508.702195423162;2246.2362796649136;2277.6128058230142;2287.542491501698;2288.828337874658;2291.186628746796;1998.2406685459578;2066.431731273904;2285.5771682238756;2334.509752951882;2339.578875802355;2204.2395373596164;2270.386995511211;2271.3640180749417;2277.7038984931937;2285.5428914217223;2240.7535171131162;2290.610596198642;2293.942651433711;2315.7568455312116;2324.7094113235844;2277.6355783074628;2283.931482055541;2302.021640802669;2305.043406986099;2310.4916918277954;8443.57782110892;8605.526696031715;8609.31125509964;8609.440386374928;8611.784705382353;5031.974840125813;5175.120229560984;5184;5184.377874655028;5186.507281808223;3296.47256438971;3385.25524384635;3401.3027329397414;3449.910907248708;3474.7567670263093;1071.2929466552116;1075.2150929821196;1093.2675107677876;1111.5942680921405;1135.5117299561186;11632.069434445224;11691.415429228504;11708.473118709679;11708.590199342982;11709.297442153413;4305.634021108241;4470.329450582439;4524.366588677588;4534.2745160774775;4647.488776234612;9804.460754658563;9815.656452024288;9827.606895724091;9830.311878168603;9833.655822046194;5118.923216151761;5122.795088196431;5126.6923984561045;5129.230615407719;5130.666506677054;4557.407537020166;4708.882277943078;4710.3405523226775;4735.692180008357;4780.593649539758;3648.8175591220333;3739.3082279778328;3751.962480375216;3789.8484060637816;3816.885493435201;1157.7626586549904;1186.0689358853258;1222.1628184693514;1285.8521270053877;1287.2212311551377;908.2824568590739;958.075457183821;958.2621381536178;962.3985009369144;963.2438535749403;5704.686242256716;5851.531877449794;5897.941020589825;5911.201987731687;6036.685162268922;920.3327587499143;947.4788866123605;963.2534785541261;968.665810295461;977.8826540815147;4035.6771458283265;4038.2932986727205;4042.211768705133;4055.128147448254;4070.4504891839815;10285.948570257251;10566.154707623371;10648;10664.946675266574;10666.14670826332;10111.544980475895;10279.331843430153;10580.047795698423;10591.046805787517;10610;7747.636970723984;7809.258120478546;7810.804729881685;7811.531308121531;7814.296713295717;5360.892782144413;5377.704226267437;5419.268398766116;5526.143447765603;5570.972145139248;9338.066193380608;9353.766155845886;9474.289428292768;9514.33399662017;9655.662051828152;9683.080107389787;9730;9801.509924503604;9838.901610984085;9895;7252.166000909963;7489;7494.175640679412;7568.3945284378215;7581.696732130874;8146.2261085196815;8314.916850831414;8319.750407487785;8323.084460709439;8330.833383332421;7039.190493093155;7118.394936430462;7170.139583250043;7195.13658361;7520.09758828944;7077.5753454792875;7135.357817796424;7216.097987751531;7249.130104387507;7301.926980730124;6670.633115178518;6810.387065164159;6816.863662726817;6820.693068811816;6823.454123670193;4838.564529192389;4873.220284754422;4921.827736029221;4957.355543779286;5045.62157838171;4913.77887995034;5058.519440653132;5132.204508301219;5143.948560514496;5207.895842083213 03:38:17 INFO - PROCESS | 6334 | |4;prototype.html;318.697237624257;325.89734233716376;329.67526985918863;330.1021222275413;332.5394328854537;5330.653507522008;5372.862895570408;5431.83704488865;5437.700926449049;5447.564194864412;5230.300152450459;5269.6311258211945;5301.973490132554;5324.600654950875;5335.359756829176;3917.78452185129;4008.859689910854;4019.1358857845557;4083.4895638045246;4131.690123240754;4110.77390743509;4119.8352065917325;4119.876403707878;4125.504939407276;4126.46355973723;4055.0065234017707;4086.284900142478;4088.7342322748927;4098.364753463203;4128.339465685491;3931.8820435386983;4030.0932290234755;4049.75701457912;4095.344744840811;4119.629233369011;3643.3806252937065;3646.5806432260365;3647.379945409287;3647.960331305565;3654.707623390149;5141.948580514222;5160.277561141405;5163.406208286057;5182.119039763249;5204.76578553966;4624.838130665445;4675.672702910798;4717.952820471785;4726.692764970266;4736.147493451177;5466.781328746845;5470.206820011116;5480.314960629921;5494.890102197934;5497.505224529771;4028.650402115295;4029.5164580250557;4033.3949907513816;4061.79691015451;4069.7558146511305;5663.405342439067;5681.431856814327;5719.14212868069;5745.511631511326;5848.572842270495;4061;4075;4079.3880917862557;4086.325756250245;4088.7137900347284;4130.607592278789;4134.152498737752;4145.626893579592;4168.83272683643;4170.311898536768;4575.2450845610765;4684.180268453007;4723.456802467692;4728.243481043017;4732.266498692708;5505.256790333254;5513.030617955066;5513.476219759116;5514.365847927459;5515.310586176728;1385.1758203868683;1386.2514242309242;1387.3202130955758;1393.7630602797549;1401.341369556307;919.5540163020929;929.9491574520883;975.3075316525204;979.9167070798919;997;5027.069992051483;5259.158534634516;5398.541124004425;5403.675779453245;5405.621606487508;5701.2018317435595;5701.743421546041;5730.770769169187;5733.799317023884;5743.8564035899435;5252.29094072303;5365.38298095724;5395.757190926418;5397.4062853086125;5417.214503896913;2904.143277733074;2907.3458471844087;2912.7087291271127;2916.824990500577;2925.663548691885;5608.747606357723;5645.774169033275;5651.378348381675;5683.403242659461;5686.886262274731;5367.865803354947;5584.525315348241;5607.186957891165;5631.80288689902;5667.404922483162;5576.721163941867;5628.718564071698;5638.746256418389;5646.604737668324;5655.434456554394;5281.339832520935;5426.213199086189;5446.264754258124;5471.6169868108855;5548.722563871871;5462.289902312674;5468.894475626833;5475.370332411664;5476.561875050066;5494.917576236279;5637.49262566371;5662.292213473316;5671.574631902541;5672.801451949162;5696.604331938702;3830.9808450957566;3998.7600743955454;4015.257177422186;4024.315866302794;4040;5444.733160103906;5456.072467680425;5459.535939445192;5493.835184944458;5497.422770609029;5242.501962313574;5291.232771248225;5295.816305118913;5384.300040994645;5395.3525576931015;5092.337996060489;5284.524392804666;5302.700838294642;5323.429588271391;5330.9733451332495;5219.164933610604;5229.660072095302;5230.241614965885;5238.397584277857;5241.528262456397;5281.313429254326;5458.062387852256;5467.808626698046;5595.692236927008;5608.747606357642;5426.972865135649;5463.125899856004;5483.643563168382;5485.670859748428;5486.396496385474 03:38:17 INFO - PROCESS | 6334 | |5;yui.html;723.7286017743346;747.7382915979405;771.1324759645398;791.774344311871;816.3795515408287;13800.240986745725;14685.33915973781;14686.559403217894;14709;14719.190444525548;13651.385687644055;13814.65463363414;13816.930915345434;13816.930915345434;13818.861811381908;652.8890088684935;671.4091599392527;771.3636250093667;775.2402645407504;789.928906398424;783.8941742864697;793.5119901260712;793.714262865368;793.8412317536515;794.6106407860165;833.0212000898949;833.1335411172404;833.4291010657688;835.0480452284401;837.0374069819695;689.3382352941182;700.817787375281;792.2434075457924;823.3372135430976;824.5258976088743;592.2567178191342;600.6096037575611;600.7026521871702;601.3475379213559;602.8854517641633;13319.200847949058;13343.199408035549;13361.064725469221;13365.198088114646;13374.933125334408;13018.739625207538;13055.543055992996;13236.338183090904;13290.136141150795;13323.733525329537;11850.051995840313;11918.284902905767;12187.268763874195;12220.633380998584;12653.873461265453;3961.267165574378;4126.133511962462;4250.447441832542;4358.716683415568;4374.890627734332;63524.364756352305;64815.67592162056;65279.673601631686;65340.34659653438;66503.99999999952;10797.676069717763;10811;10896.61861834832;11046.668599942015;11157.609483668033;17612.383566575107;18530.351437699617;19906.90046549758;19975.300864469675;20144.39566812998;7798.298153166129;7849.411294152847;7951.324137448381;8116.675332986614;8119.83760324802;4361.520232774392;4473.642108631302;4560.612347950461;4566.360709500673;4670.346151538787;3418.8974330770116;3489.5812502499357;3526.20660351424;3527.735419843522;3531.752777305564;602.4728362682653;608.9177960975301;614;619.6994457688018;625.4652272307203;613.5980932489226;638.8147437243148;709.9645017749092;719.5567371481084;743.1528058013869;8797.29621630268;8912.287017038621;9329.72010839676;9393.342466027312;9501.23990080792;695.6417445015821;698.7135274537517;704.8731228378839;732.4287056096254;735.6873328835223;4323.589259020388;4567.086582683477;4581.679282450196;4617.464554373053;4639.536046395334;81002;81096.18903811004;83964.58017709872;85269.14730852736;86972;46805;55969.720151398986;72236.63881680663;73536.63231683808;76062;54479.455205448234;59681;61117;61615.38384616186;63406;9380.624775009197;9513.762155946157;10009.299349045497;10014.64948726791;10020.799584008133;42780.78609606932;43961;44461;44659.55340446684;45509.77245113886;50285.49714502808;51645.7417712909;52380;57152.42847571638;57410;12000.099992500773;12093.879061209274;12228.327441990776;12397.690057748629;12739.171953822972;14000.719985600435;14181.503647372705;14293.499727509487;14294.499692510712;14768.63078423048;12754.170978886343;12819.294938778085;13005.934970325088;13610.053084605353;13618.455261789417;12508.437120329425;12600.684982875502;12833.743325133632;13011.934940325238;13932.233727145105;12649.757364567835;12796.680082998;12830.935845320713;13036.217826930415;13055.608331750063;9944.850827237742;10075.395476271447;10378.42918639482;10686.946565267124;10863.891361086287;10148.289619726549;10679.305845120043;11131.499082541468;11177.497012634289;11252.437378131224 03:38:17 INFO - PROCESS | 6334 | __end_tp_report 03:38:17 INFO - PROCESS | 6334 | __start_cc_report 03:38:17 INFO - PROCESS | 6334 | _x_x_mozilla_cycle_collect,1189 03:38:17 INFO - PROCESS | 6334 | __end_cc_report 03:38:17 INFO - PROCESS | 6334 | __startTimestamp1479987497737__endTimestamp 03:38:17 INFO - PROCESS | 6334 | 03:38:17 INFO - PROCESS | 6334 | ------- Summary: start ------- 03:38:17 INFO - PROCESS | 6334 | Number of tests: 6 03:38:17 INFO - PROCESS | 6334 | 03:38:17 INFO - PROCESS | 6334 | [#0] dojo.html Cycles:165 Average:5327.79 Median:5554.47 stddev:700.68 (12.6%) stddev-sans-first:678.93 03:38:17 INFO - PROCESS | 6334 | Values: 3014.7 3056.4 3075.5 3085.1 3086.3 5300.9 5347.9 5392.3 5438.8 5475.5 5393.6 5404.4 5407.3 5413.1 5421.9 4847.4 4899.5 4900.5 4905.4 4982.5 4916.6 4926.7 4947.4 4976.3 5024.3 753.1 4967.8 4985.0 4987.1 5031.1 4353.7 4940.4 4962.8 4968.9 5033.3 4935.8 4936.4 4936.9 4940.5 4982.6 5401.4 5404.2 5420.7 5444.3 5448.5 5538.2 5625.6 5633.9 5676.7 5687.1 5767.5 5781.9 5793.3 5826.0 5842.4 5368.4 5378.5 5387.1 5388.5 5421.9 5748.6 5793.7 5809.4 5871.5 5892.6 5637.5 5645.5 5684.1 5759.4 5778.3 5693.9 5797.4 5802.3 5804.7 5804.8 5783.2 5783.9 5784.9 5805.5 5808.1 5581.9 5599.9 5643.8 5712.3 5772.4 4436.3 4436.5 4455.8 4476.3 4477.0 3940.9 3944.9 3957.4 3975.0 3981.2 5345.3 5356.7 5507.9 5512.6 5516.9 5694.8 5712.6 5717.6 5750.0 5804.0 5400.9 5430.8 5443.4 5446.4 5448.3 4897.6 4975.5 4980.2 4987.0 5028.0 5834.1 5906.9 5949.5 5953.7 6039.3 5789.2 5790.8 5797.3 5798.5 5802.4 5885.9 5940.0 5947.6 5950.8 5953.8 5526.0 5572.1 5654.1 5684.2 5696.1 5788.8 5840.8 5843.6 5845.5 5880.3 5601.1 5639.0 5639.7 5642.4 5646.4 5502.7 5554.5 5557.3 5585.4 5624.9 5597.9 5602.4 5613.4 5645.0 5651.7 5536.8 5643.1 5689.1 5694.8 5696.6 5448.5 5533.6 5534.3 5541.0 5564.2 03:38:17 INFO - PROCESS | 6334 | 03:38:17 INFO - PROCESS | 6334 | [#1] ext.html Cycles:180 Average:55169.26 Median:361302.50 stddev:102749.09 (28.4%) stddev-sans-first:102955.46 03:38:17 INFO - PROCESS | 6334 | Values: 538.2 596.4 607.2 618.8 641.7 31696.0 41976.6 42571.0 42656.6 42755.4 42854.8 43240.8 43261.0 43290.0 43358.8 7859.7 8042.6 8503.3 8646.9 8653.6 9858.2 10093.9 10098.0 10404.7 10415.9 10243.9 10300.7 10303.4 10315.9 10318.5 10177.3 10223.6 10223.6 10225.8 10233.3 10110.0 10161.8 10170.1 10171.3 10173.0 40883.2 41077.8 41205.8 41255.8 41299.8 3386.4 3516.9 3583.9 3812.4 3870.3 28681.0 28797.4 28805.7 30386.0 32591.7 4104.6 4170.4 4232.9 4346.2 4369.1 341808.0 344820.0 345888.3 346583.0 350492.0 56277.4 56808.7 57004.7 57269.0 57353.0 59476.0 59549.4 59579.0 59599.0 59602.0 15479.2 15831.4 15937.4 16021.5 16044.6 11356.3 11382.3 11594.9 11789.6 12369.5 16457.5 16491.0 16788.9 16800.2 16801.3 6487.3 6516.4 6600.4 6702.7 6804.6 918.7 972.8 1003.9 1027.3 1039.3 29987.0 30242.7 30247.0 30780.4 30808.8 1058.2 1071.3 1089.6 1098.7 1132.7 15232.5 16067.7 16115.9 16206.9 16451.2 448891.0 449549.0 454248.0 454697.0 455650.0 56143.7 56404.4 56469.7 56776.4 56871.0 1227.2 1246.2 1288.8 1339.2 1361.9 27123.0 31346.5 31620.4 31963.5 32121.4 48992.8 49457.8 49475.0 49501.8 49607.5 361182.0 361423.0 362292.8 363006.0 363169.0 27060.2 27592.4 27848.0 29376.3 39729.6 46584.3 46732.8 46879.5 47189.8 48063.8 38598.2 38832.2 39066.6 40200.4 40717.6 38897.8 39140.2 39598.4 39789.2 40678.0 38591.0 40423.2 41467.6 41571.8 41753.6 31259.5 35198.6 35279.3 35978.8 35996.8 26755.2 27051.9 27254.6 27389.3 27585.0 03:38:17 INFO - PROCESS | 6334 | 03:38:17 INFO - PROCESS | 6334 | [#2] jquery.html Cycles:180 Average:25767.36 Median:20128.84 stddev:69042.19 (343.0%) stddev-sans-first:69209.55 03:38:17 INFO - PROCESS | 6334 | Values: 373.9 391.2 395.2 399.7 419.4 13311.9 15310.9 16781.6 18625.4 19347.9 18417.7 18504.8 19019.8 19022.8 19034.4 5418.3 5664.3 5665.2 5665.9 5669.1 3839.6 4011.3 5476.0 5512.6 5756.5 5711.3 5756.2 5794.4 5799.2 5805.0 5616.4 5702.0 5735.5 5747.7 5813.5 5567.2 5571.4 5573.2 5575.3 5595.8 13387.0 17192.6 19614.6 22223.3 22462.7 2264.7 2291.9 2464.6 2547.9 2645.7 8186.1 9171.6 9663.7 10108.9 10191.6 1825.7 1872.5 1885.7 1895.6 2002.6 68945.7 74433.3 77375.6 78878.0 79113.2 10678.3 10695.4 10696.2 10983.4 11100.8 15376.9 15387.6 15394.8 15397.7 15402.8 7683.0 7824.2 7854.0 8017.5 8021.1 7416.2 7417.6 7428.6 7620.8 7634.3 4393.3 4547.9 4575.2 4585.2 4746.8 1812.2 1875.1 1943.9 1994.9 2019.6 840.8 909.8 937.5 991.9 993.1 17728.4 18931.0 19022.4 19138.6 19372.2 907.5 948.3 964.7 1012.7 1015.1 10384.9 10658.4 10661.7 10679.8 10793.1 410922.0 419061.0 420715.0 421348.0 421957.0 51980.7 70909.6 70939.0 86957.0 88094.6 948.7 980.6 985.4 995.7 1000.5 12525.6 16125.8 17181.9 17192.1 17512.2 38474.5 39505.2 39858.0 40466.2 40484.0 48937.3 51076.2 55160.0 57381.0 57432.4 7574.5 7795.8 7859.4 7967.7 8127.2 11273.3 12110.1 12388.9 12401.1 12771.5 10751.9 10778.9 10834.2 11099.5 11516.8 10874.2 11105.9 11144.4 11221.3 11750.1 11065.8 11207.8 11280.2 11319.5 11400.5 7768.7 7941.0 7983.8 8182.5 8524.6 9631.0 11203.3 11320.4 11482.3 11897.3 03:38:17 INFO - PROCESS | 6334 | 03:38:17 INFO - PROCESS | 6334 | [#3] mootools.html Cycles:180 Average:5574.55 Median:5127.96 stddev:3121.08 (60.9%) stddev-sans-first:3114.42 03:38:17 INFO - PROCESS | 6334 | Values: 1447.4 1467.9 1580.3 1674.6 1740.4 7534.5 7710.4 8004.4 8607.6 8611.4 7965.8 8303.8 8315.3 8504.2 8508.7 2246.2 2277.6 2287.5 2288.8 2291.2 1998.2 2066.4 2285.6 2334.5 2339.6 2204.2 2270.4 2271.4 2277.7 2285.5 2240.8 2290.6 2293.9 2315.8 2324.7 2277.6 2283.9 2302.0 2305.0 2310.5 8443.6 8605.5 8609.3 8609.4 8611.8 5032.0 5175.1 5184.0 5184.4 5186.5 3296.5 3385.3 3401.3 3449.9 3474.8 1071.3 1075.2 1093.3 1111.6 1135.5 11632.1 11691.4 11708.5 11708.6 11709.3 4305.6 4470.3 4524.4 4534.3 4647.5 9804.5 9815.7 9827.6 9830.3 9833.7 5118.9 5122.8 5126.7 5129.2 5130.7 4557.4 4708.9 4710.3 4735.7 4780.6 3648.8 3739.3 3752.0 3789.8 3816.9 1157.8 1186.1 1222.2 1285.9 1287.2 908.3 958.1 958.3 962.4 963.2 5704.7 5851.5 5897.9 5911.2 6036.7 920.3 947.5 963.3 968.7 977.9 4035.7 4038.3 4042.2 4055.1 4070.5 10285.9 10566.2 10648.0 10664.9 10666.1 10111.5 10279.3 10580.0 10591.0 10610.0 7747.6 7809.3 7810.8 7811.5 7814.3 5360.9 5377.7 5419.3 5526.1 5571.0 9338.1 9353.8 9474.3 9514.3 9655.7 9683.1 9730.0 9801.5 9838.9 9895.0 7252.2 7489.0 7494.2 7568.4 7581.7 8146.2 8314.9 8319.8 8323.1 8330.8 7039.2 7118.4 7170.1 7195.1 7520.1 7077.6 7135.4 7216.1 7249.1 7301.9 6670.6 6810.4 6816.9 6820.7 6823.5 4838.6 4873.2 4921.8 4957.4 5045.6 4913.8 5058.5 5132.2 5143.9 5207.9 03:38:17 INFO - PROCESS | 6334 | 03:38:17 INFO - PROCESS | 6334 | [#4] prototype.html Cycles:180 Average:4606.26 Median:5293.52 stddev:1337.16 (25.3%) stddev-sans-first:1301.61 03:38:17 INFO - PROCESS | 6334 | Values: 318.7 325.9 329.7 330.1 332.5 5330.7 5372.9 5431.8 5437.7 5447.6 5230.3 5269.6 5302.0 5324.6 5335.4 3917.8 4008.9 4019.1 4083.5 4131.7 4110.8 4119.8 4119.9 4125.5 4126.5 4055.0 4086.3 4088.7 4098.4 4128.3 3931.9 4030.1 4049.8 4095.3 4119.6 3643.4 3646.6 3647.4 3648.0 3654.7 5141.9 5160.3 5163.4 5182.1 5204.8 4624.8 4675.7 4718.0 4726.7 4736.1 5466.8 5470.2 5480.3 5494.9 5497.5 4028.7 4029.5 4033.4 4061.8 4069.8 5663.4 5681.4 5719.1 5745.5 5848.6 4061.0 4075.0 4079.4 4086.3 4088.7 4130.6 4134.2 4145.6 4168.8 4170.3 4575.2 4684.2 4723.5 4728.2 4732.3 5505.3 5513.0 5513.5 5514.4 5515.3 1385.2 1386.3 1387.3 1393.8 1401.3 919.6 929.9 975.3 979.9 997.0 5027.1 5259.2 5398.5 5403.7 5405.6 5701.2 5701.7 5730.8 5733.8 5743.9 5252.3 5365.4 5395.8 5397.4 5417.2 2904.1 2907.3 2912.7 2916.8 2925.7 5608.7 5645.8 5651.4 5683.4 5686.9 5367.9 5584.5 5607.2 5631.8 5667.4 5576.7 5628.7 5638.7 5646.6 5655.4 5281.3 5426.2 5446.3 5471.6 5548.7 5462.3 5468.9 5475.4 5476.6 5494.9 5637.5 5662.3 5671.6 5672.8 5696.6 3831.0 3998.8 4015.3 4024.3 4040.0 5444.7 5456.1 5459.5 5493.8 5497.4 5242.5 5291.2 5295.8 5384.3 5395.4 5092.3 5284.5 5302.7 5323.4 5331.0 5219.2 5229.7 5230.2 5238.4 5241.5 5281.3 5458.1 5467.8 5595.7 5608.7 5427.0 5463.1 5483.6 5485.7 5486.4 03:38:17 INFO - PROCESS | 6334 | 03:38:17 INFO - PROCESS | 6334 | [#5] yui.html Cycles:180 Average:16835.61 Median:4563.49 stddev:21575.85 (472.8%) stddev-sans-first:21602.46 03:38:17 INFO - PROCESS | 6334 | Values: 723.7 747.7 771.1 791.8 816.4 13800.2 14685.3 14686.6 14709.0 14719.2 13651.4 13814.7 13816.9 13816.9 13818.9 652.9 671.4 771.4 775.2 789.9 783.9 793.5 793.7 793.8 794.6 833.0 833.1 833.4 835.0 837.0 689.3 700.8 792.2 823.3 824.5 592.3 600.6 600.7 601.3 602.9 13319.2 13343.2 13361.1 13365.2 13374.9 13018.7 13055.5 13236.3 13290.1 13323.7 11850.1 11918.3 12187.3 12220.6 12653.9 3961.3 4126.1 4250.4 4358.7 4374.9 63524.4 64815.7 65279.7 65340.3 66504.0 10797.7 10811.0 10896.6 11046.7 11157.6 17612.4 18530.4 19906.9 19975.3 20144.4 7798.3 7849.4 7951.3 8116.7 8119.8 4361.5 4473.6 4560.6 4566.4 4670.3 3418.9 3489.6 3526.2 3527.7 3531.8 602.5 608.9 614.0 619.7 625.5 613.6 638.8 710.0 719.6 743.2 8797.3 8912.3 9329.7 9393.3 9501.2 695.6 698.7 704.9 732.4 735.7 4323.6 4567.1 4581.7 4617.5 4639.5 81002.0 81096.2 83964.6 85269.1 86972.0 46805.0 55969.7 72236.6 73536.6 76062.0 54479.5 59681.0 61117.0 61615.4 63406.0 9380.6 9513.8 10009.3 10014.6 10020.8 42780.8 43961.0 44461.0 44659.6 45509.8 50285.5 51645.7 52380.0 57152.4 57410.0 12000.1 12093.9 12228.3 12397.7 12739.2 14000.7 14181.5 14293.5 14294.5 14768.6 12754.2 12819.3 13005.9 13610.1 13618.5 12508.4 12600.7 12833.7 13011.9 13932.2 12649.8 12796.7 12830.9 13036.2 13055.6 9944.9 10075.4 10378.4 10686.9 10863.9 10148.3 10679.3 11131.5 11177.5 11252.4 03:38:17 INFO - PROCESS | 6334 | -------- Summary: end -------- 03:38:17 INFO - PROCESS | 6334 | 03:38:18 INFO - TEST-INFO | 6334: exit 0 03:38:18 INFO - TEST-OK | dromaeo_css | took 1118311ms 03:38:18 INFO - TEST-START | kraken 03:38:18 INFO - operating with platform_type : linux_ 03:38:18 INFO - Initialising browser for kraken test... 03:38:18 INFO - TEST-INFO | started process 6640 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmp81mUv2/profile http://localhost:49144/getInfo.html) 03:38:22 INFO - PROCESS | 6640 | __metrics Screen width/height:1600/1200 03:38:22 INFO - PROCESS | 6640 | colorDepth:24 03:38:22 INFO - PROCESS | 6640 | Browser inner width/height: 1024/697 03:38:22 INFO - PROCESS | 6640 | __metrics 03:38:23 INFO - PROCESS | 6640 | JavaScript error: resource://gre/modules/AsyncShutdown.jsm, line 692: Error: Phase "quit-application-granted" is finished, it is too late to register completion condition "SessionStore: flushing all windows" 03:38:23 INFO - PROCESS | 6640 | JavaScript error: resource://app/modules/BrowserUsageTelemetry.jsm, line 211: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 03:38:24 INFO - PROCESS | 6640 | console.error: PushService: 03:38:24 INFO - PROCESS | 6640 | stateChangeProcessEnqueue: Error transitioning state 03:38:24 INFO - PROCESS | 6640 | UnknownError 03:38:24 INFO - TEST-INFO | 6640: exit 0 03:38:24 INFO - Browser initialized. 03:38:24 INFO - Running cycle 1/1 for kraken test... 03:38:24 INFO - TEST-INFO | started process 6726 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmp81mUv2/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 03:38:36 INFO - PROCESS | 6726 | RSS: Main: 173285376 03:38:36 INFO - PROCESS | 6726 | 03:38:39 INFO - PROCESS | 6726 | Cycle 1(1): loaded http://localhost:49144/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:49144/tests/kraken/driver.html?testName=audio-beat-detection) 03:38:40 INFO - PROCESS | 6726 | RSS: Main: 234016768 03:38:40 INFO - PROCESS | 6726 | 03:38:43 INFO - PROCESS | 6726 | Cycle 1(1): loaded http://localhost:49144/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:49144/tests/kraken/driver.html?testName=audio-dft) 03:38:43 INFO - PROCESS | 6726 | RSS: Main: 217272320 03:38:43 INFO - PROCESS | 6726 | 03:38:46 INFO - PROCESS | 6726 | Cycle 1(1): loaded http://localhost:49144/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:49144/tests/kraken/driver.html?testName=audio-fft) 03:38:47 INFO - PROCESS | 6726 | RSS: Main: 298696704 03:38:47 INFO - PROCESS | 6726 | 03:38:49 INFO - PROCESS | 6726 | Cycle 1(1): loaded http://localhost:49144/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:49144/tests/kraken/driver.html?testName=audio-oscillator) 03:38:49 INFO - PROCESS | 6726 | RSS: Main: 210247680 03:38:49 INFO - PROCESS | 6726 | 03:38:52 INFO - PROCESS | 6726 | Cycle 1(1): loaded http://localhost:49144/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:49144/tests/kraken/driver.html?testName=imaging-gaussian-blur) 03:38:52 INFO - PROCESS | 6726 | RSS: Main: 213409792 03:38:52 INFO - PROCESS | 6726 | 03:38:55 INFO - PROCESS | 6726 | Cycle 1(1): loaded http://localhost:49144/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:49144/tests/kraken/driver.html?testName=imaging-darkroom) 03:38:56 INFO - PROCESS | 6726 | RSS: Main: 252399616 03:38:56 INFO - PROCESS | 6726 | 03:38:59 INFO - PROCESS | 6726 | Cycle 1(1): loaded http://localhost:49144/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:49144/tests/kraken/driver.html?testName=imaging-desaturate) 03:39:00 INFO - PROCESS | 6726 | RSS: Main: 252227584 03:39:00 INFO - PROCESS | 6726 | 03:39:03 INFO - PROCESS | 6726 | Cycle 1(1): loaded http://localhost:49144/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:49144/tests/kraken/driver.html?testName=json-parse-financial) 03:39:03 INFO - PROCESS | 6726 | RSS: Main: 251580416 03:39:03 INFO - PROCESS | 6726 | 03:39:05 INFO - PROCESS | 6726 | Cycle 1(1): loaded http://localhost:49144/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:49144/tests/kraken/driver.html?testName=json-stringify-tinderbox) 03:39:05 INFO - PROCESS | 6726 | RSS: Main: 213778432 03:39:05 INFO - PROCESS | 6726 | 03:39:07 INFO - PROCESS | 6726 | Cycle 1(1): loaded http://localhost:49144/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:49144/tests/kraken/driver.html?testName=stanford-crypto-aes) 03:39:08 INFO - PROCESS | 6726 | RSS: Main: 220921856 03:39:08 INFO - PROCESS | 6726 | 03:39:10 INFO - PROCESS | 6726 | Cycle 1(1): loaded http://localhost:49144/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:49144/tests/kraken/driver.html?testName=stanford-crypto-ccm) 03:39:10 INFO - PROCESS | 6726 | RSS: Main: 229785600 03:39:10 INFO - PROCESS | 6726 | 03:39:13 INFO - PROCESS | 6726 | Cycle 1(1): loaded http://localhost:49144/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:49144/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 03:39:14 INFO - PROCESS | 6726 | RSS: Main: 237879296 03:39:14 INFO - PROCESS | 6726 | 03:39:16 INFO - PROCESS | 6726 | Cycle 1(1): loaded http://localhost:49144/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:49144/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 03:39:17 INFO - PROCESS | 6726 | RSS: Main: 235651072 03:39:17 INFO - PROCESS | 6726 | 03:39:19 INFO - PROCESS | 6726 | Cycle 1(1): loaded http://localhost:49144/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:49144/tests/kraken/driver.html?testName=ai-astar) 03:39:19 INFO - PROCESS | 6726 | RSS: Main: 286519296 03:39:19 INFO - PROCESS | 6726 | 03:39:19 INFO - PROCESS | 6726 | __start_tp_report 03:39:19 INFO - PROCESS | 6726 | _x_x_mozilla_page_load 03:39:19 INFO - PROCESS | 6726 | _x_x_mozilla_page_load_details 03:39:19 INFO - PROCESS | 6726 | |i|pagename|runs| 03:39:19 INFO - PROCESS | 6726 | |0;ai-astar;104;111;110;112;112;112;111;112;111;112 03:39:19 INFO - PROCESS | 6726 | |1;audio-beat-detection;158;126;124;158;125;127;127;124;149;125 03:39:19 INFO - PROCESS | 6726 | |2;audio-dft;160;160;161;163;163;165;163;162;161;161 03:39:19 INFO - PROCESS | 6726 | |3;audio-fft;76;76;75;107;77;76;76;76;100;76 03:39:19 INFO - PROCESS | 6726 | |4;audio-oscillator;83;83;116;82;82;81;105;83;84;112 03:39:19 INFO - PROCESS | 6726 | |5;imaging-gaussian-blur;117;117;116;117;117;117;117;117;117;117 03:39:19 INFO - PROCESS | 6726 | |6;imaging-darkroom;146;146;146;146;146;146;146;146;146;146 03:39:19 INFO - PROCESS | 6726 | |7;imaging-desaturate;95;95;95;95;96;95;95;96;96;97 03:39:19 INFO - PROCESS | 6726 | |8;json-parse-financial;52;52;50;51;53;54;53;52;52;51 03:39:19 INFO - PROCESS | 6726 | |9;json-stringify-tinderbox;62;61;61;62;62;62;62;62;62;62 03:39:19 INFO - PROCESS | 6726 | |10;stanford-crypto-aes;82;81;80;81;81;82;81;81;81;82 03:39:19 INFO - PROCESS | 6726 | |11;stanford-crypto-ccm;140;144;134;148;140;135;141;141;191;130 03:39:19 INFO - PROCESS | 6726 | |12;stanford-crypto-pbkdf2;169;168;167;164;165;163;170;165;167;166 03:39:19 INFO - PROCESS | 6726 | |13;stanford-crypto-sha256-iterative;67;67;65;64;66;65;66;66;69;65 03:39:19 INFO - PROCESS | 6726 | __end_tp_report 03:39:19 INFO - PROCESS | 6726 | __start_cc_report 03:39:19 INFO - PROCESS | 6726 | _x_x_mozilla_cycle_collect,1702 03:39:19 INFO - PROCESS | 6726 | __end_cc_report 03:39:19 INFO - PROCESS | 6726 | __startTimestamp1479987559533__endTimestamp 03:39:19 INFO - PROCESS | 6726 | 03:39:19 INFO - PROCESS | 6726 | ------- Summary: start ------- 03:39:19 INFO - PROCESS | 6726 | Number of tests: 14 03:39:19 INFO - PROCESS | 6726 | 03:39:19 INFO - PROCESS | 6726 | [#0] ai-astar Cycles:10 Average:110.70 Median:112.00 stddev:2.45 (2.2%) stddev-sans-first:0.73 03:39:19 INFO - PROCESS | 6726 | Values: 104.0 111.0 110.0 112.0 112.0 112.0 111.0 112.0 111.0 112.0 03:39:19 INFO - PROCESS | 6726 | 03:39:19 INFO - PROCESS | 6726 | [#1] audio-beat-detection Cycles:10 Average:134.30 Median:127.00 stddev:14.53 (11.4%) stddev-sans-first:12.63 03:39:19 INFO - PROCESS | 6726 | Values: 158.0 126.0 124.0 158.0 125.0 127.0 127.0 124.0 149.0 125.0 03:39:19 INFO - PROCESS | 6726 | 03:39:19 INFO - PROCESS | 6726 | [#2] audio-dft Cycles:10 Average:161.90 Median:162.50 stddev:1.60 (1.0%) stddev-sans-first:1.54 03:39:19 INFO - PROCESS | 6726 | Values: 160.0 160.0 161.0 163.0 163.0 165.0 163.0 162.0 161.0 161.0 03:39:19 INFO - PROCESS | 6726 | 03:39:19 INFO - PROCESS | 6726 | [#3] audio-fft Cycles:10 Average:81.50 Median:76.00 stddev:11.72 (15.4%) stddev-sans-first:12.26 03:39:19 INFO - PROCESS | 6726 | Values: 76.0 76.0 75.0 107.0 77.0 76.0 76.0 76.0 100.0 76.0 03:39:19 INFO - PROCESS | 6726 | 03:39:19 INFO - PROCESS | 6726 | [#4] audio-oscillator Cycles:10 Average:91.10 Median:82.50 stddev:14.00 (17.0%) stddev-sans-first:14.54 03:39:19 INFO - PROCESS | 6726 | Values: 83.0 83.0 116.0 82.0 82.0 81.0 105.0 83.0 84.0 112.0 03:39:19 INFO - PROCESS | 6726 | 03:39:19 INFO - PROCESS | 6726 | [#5] imaging-gaussian-blur Cycles:10 Average:116.90 Median:117.00 stddev:0.32 (0.3%) stddev-sans-first:0.33 03:39:19 INFO - PROCESS | 6726 | Values: 117.0 117.0 116.0 117.0 117.0 117.0 117.0 117.0 117.0 117.0 03:39:19 INFO - PROCESS | 6726 | 03:39:19 INFO - PROCESS | 6726 | [#6] imaging-darkroom Cycles:10 Average:146.00 Median:146.00 stddev:0.00 (0.0%) stddev-sans-first:0.00 03:39:19 INFO - PROCESS | 6726 | Values: 146.0 146.0 146.0 146.0 146.0 146.0 146.0 146.0 146.0 146.0 03:39:19 INFO - PROCESS | 6726 | 03:39:19 INFO - PROCESS | 6726 | [#7] imaging-desaturate Cycles:10 Average:95.50 Median:95.50 stddev:0.71 (0.7%) stddev-sans-first:0.73 03:39:19 INFO - PROCESS | 6726 | Values: 95.0 95.0 95.0 95.0 96.0 95.0 95.0 96.0 96.0 97.0 03:39:19 INFO - PROCESS | 6726 | 03:39:19 INFO - PROCESS | 6726 | [#8] json-parse-financial Cycles:10 Average:52.00 Median:52.00 stddev:1.15 (2.2%) stddev-sans-first:1.22 03:39:19 INFO - PROCESS | 6726 | Values: 52.0 52.0 50.0 51.0 53.0 54.0 53.0 52.0 52.0 51.0 03:39:19 INFO - PROCESS | 6726 | 03:39:19 INFO - PROCESS | 6726 | [#9] json-stringify-tinderbox Cycles:10 Average:61.80 Median:62.00 stddev:0.42 (0.7%) stddev-sans-first:0.44 03:39:19 INFO - PROCESS | 6726 | Values: 62.0 61.0 61.0 62.0 62.0 62.0 62.0 62.0 62.0 62.0 03:39:19 INFO - PROCESS | 6726 | 03:39:19 INFO - PROCESS | 6726 | [#10] stanford-crypto-aes Cycles:10 Average:81.20 Median:81.00 stddev:0.63 (0.8%) stddev-sans-first:0.60 03:39:19 INFO - PROCESS | 6726 | Values: 82.0 81.0 80.0 81.0 81.0 82.0 81.0 81.0 81.0 82.0 03:39:19 INFO - PROCESS | 6726 | 03:39:19 INFO - PROCESS | 6726 | [#11] stanford-crypto-ccm Cycles:10 Average:144.40 Median:141.00 stddev:17.16 (12.2%) stddev-sans-first:18.13 03:39:19 INFO - PROCESS | 6726 | Values: 140.0 144.0 134.0 148.0 140.0 135.0 141.0 141.0 191.0 130.0 03:39:19 INFO - PROCESS | 6726 | 03:39:19 INFO - PROCESS | 6726 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:166.40 Median:167.00 stddev:2.22 (1.3%) stddev-sans-first:2.15 03:39:19 INFO - PROCESS | 6726 | Values: 169.0 168.0 167.0 164.0 165.0 163.0 170.0 165.0 167.0 166.0 03:39:19 INFO - PROCESS | 6726 | 03:39:19 INFO - PROCESS | 6726 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:66.00 Median:66.00 stddev:1.41 (2.1%) stddev-sans-first:1.45 03:39:19 INFO - PROCESS | 6726 | Values: 67.0 67.0 65.0 64.0 66.0 65.0 66.0 66.0 69.0 65.0 03:39:19 INFO - PROCESS | 6726 | -------- Summary: end -------- 03:39:19 INFO - PROCESS | 6726 | 03:39:20 INFO - TEST-INFO | 6726: exit 0 03:39:20 INFO - TEST-OK | kraken | took 62008ms 03:39:20 INFO - SUITE-END | took 1180s 03:39:21 INFO - Completed test suite (00:19:40) 03:39:21 INFO - javascript benchmark 03:39:21 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"lowerIsBetter": false, "subtests": [{"name": "dojo.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [3014.698530146985, 3056.3734434440944, 3075.5232938894474, 3085.1207405889313, 3086.2747254395213, 5300.92048619271, 5347.866303342418, 5392.325959255093, 5438.7824487020525, 5475.479829416209, 5393.622446428752, 5404.351477822657, 5407.297051383324, 5413.052715774744, 5421.891562168754, 4847.3940757405235, 4899.48555401683, 4900.534449227318, 4905.4358748744, 4982.451930287665, 4916.631252656047, 4926.679765815228, 4947.406311242656, 4976.253561965698, 5024.321716568272, 753.1204621308456, 4967.776450059756, 4985.0, 4987.102321582114, 5031.069252188357, 4353.673474489426, 4940.382452193476, 4962.801487940478, 4968.850934471971, 5033.345665063555, 4935.753212339405, 4936.432310284327, 4936.851894443173, 4940.456549779521, 4982.57648099912, 5401.378841433247, 5404.216388623667, 5420.674759514442, 5444.292242008513, 5448.45515448456, 5538.169274608801, 5625.634333768333, 5633.887322253532, 5676.716164191816, 5687.061634830248, 5767.538596912279, 5781.855453613652, 5793.275840519935, 5826.0, 5842.444967728059, 5368.436314187033, 5378.515933565959, 5387.057264978652, 5388.5419739321815, 5421.891562168735, 5748.626339287933, 5793.710314484259, 5809.448102430262, 5871.4715675589405, 5892.646441213541, 5637.49262566371, 5645.491905728422, 5684.062129748628, 5759.424057594207, 5778.3354914184565, 5693.914591281134, 5797.420257974169, 5802.274715660543, 5804.65172089676, 5804.767809287666, 5783.161441590946, 5783.913241301384, 5784.94215057844, 5805.535557155417, 5808.128780682931, 5581.860453488614, 5599.944000559943, 5643.802466913638, 5712.285964254468, 5772.365039845614, 4436.290193569013, 4436.534163912807, 4455.77721113943, 4476.2837945928495, 4477.015056687524, 3940.9014774630864, 3944.9408258876138, 3957.3866050762176, 3974.960250397517, 3981.1838573092446, 5345.251664766935, 5356.7321633918145, 5507.889842203133, 5512.5589952803675, 5516.9448305517235, 5694.772209111589, 5712.571557133231, 5717.571182161355, 5749.993751093625, 5804.042333015005, 5400.91898621521, 5430.83707488776, 5443.374011988672, 5446.400895901447, 5448.291722076105, 4897.559219670246, 4975.502449754996, 4980.178270585313, 4986.950130498649, 5028.019536190408, 5834.095715164156, 5906.852328691817, 5949.464548190684, 5953.732082056318, 6039.335673076046, 5789.1895134680335, 5790.826275211751, 5797.275340582427, 5798.507126894261, 5802.4197580241635, 5885.911711324419, 5940.049592065248, 5947.613405128653, 5950.761969521343, 5953.7916172935475, 5525.972370138124, 5572.052751032254, 5654.06707893193, 5684.204211410323, 5696.1455781633085, 5788.82633520995, 5840.8247752567495, 5843.590948633555, 5845.503132233808, 5880.26496687914, 5601.103823388238, 5639.0, 5639.689817060101, 5642.407547207484, 5646.407127251579, 5502.724863756716, 5554.472325129106, 5557.277553917965, 5585.441455854545, 5624.85937851557, 5597.860053498695, 5602.411746766531, 5613.438656134517, 5645.040343141593, 5651.660900345993, 5536.833894983157, 5643.125315576092, 5689.089745640677, 5694.772209111755, 5696.601237913306, 5448.509634132947, 5533.5849811263515, 5534.252875861707, 5540.972295138498, 5564.165375193753], "value": 5282.808906038577, "unit": "score"}, {"name": "ext.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [538.1527260169504, 596.3708287756417, 607.2075940897129, 618.7865186510655, 641.67595364341, 31696.0, 41976.58023419765, 42571.0, 42656.57343426565, 42755.358669619905, 42854.7857260714, 43240.78379608106, 43261.0, 43290.0, 43358.783206084, 7859.724909628164, 8042.638081286327, 8503.277221436185, 8646.913530864706, 8653.567321633924, 9858.16205622523, 10093.899061009406, 10098.040686134806, 10404.739881502946, 10415.947920260389, 10243.897561024407, 10300.742481437948, 10303.433311167882, 10315.896841031607, 10318.484075796217, 10177.338472999269, 10223.591056357736, 10223.642172523925, 10225.795484090277, 10233.334833235853, 10110.039546243095, 10161.847572286422, 10170.135538479239, 10171.338862973884, 10173.03356181169, 40883.182336353406, 41077.79461102705, 41205.79397103025, 41255.7937210312, 41299.793501032604, 3386.3565922474895, 3516.929661406783, 3583.8566457341676, 3812.4281357796276, 3870.3226935286493, 28681.0, 28797.42405151906, 28805.711942880513, 30386.0, 32591.674083259102, 4104.630583247492, 4170.35359519275, 4232.894177645553, 4346.15250026245, 4369.104333611602, 341808.0, 344820.0, 345888.2705586481, 346583.0, 350492.0, 56277.43722562804, 56808.71595642078, 57004.71497642568, 57269.0, 57353.0, 59476.0, 59549.40450595525, 59579.0, 59599.0, 59602.0, 15479.226038698245, 15831.366745330288, 15937.442189523312, 16021.519354419386, 16044.598885027968, 11356.318620882774, 11382.317060976367, 11594.942025289989, 11789.646310610695, 12369.505219791108, 16457.506274811774, 16491.0, 16788.916055419646, 16800.15999200035, 16801.327946882233, 6487.286398496161, 6516.380943810331, 6600.438962688129, 6702.7381864114905, 6804.6257455840405, 918.7243826851918, 972.8346181149221, 1003.9196864250843, 1027.2603725317758, 1039.3192458939407, 29987.0, 30242.697573023986, 30247.0, 30780.384392312477, 30808.845955770077, 1058.1851973979992, 1071.3433073372605, 1089.5859573362072, 1098.6868742408535, 1132.6602019394313, 15232.543023709306, 16067.678646427006, 16115.919420402823, 16206.918965405097, 16451.177441127897, 448891.0, 449549.0, 454248.0, 454697.0, 455650.0, 56143.71928140333, 56404.435955640736, 56469.71765141148, 56776.43223567794, 56871.0, 1227.1900545639835, 1246.214884622682, 1288.7615791078492, 1339.189790176929, 1361.877431031212, 27123.0, 31346.52980205253, 31620.36759264848, 31963.520547192275, 32121.35757284888, 48992.755036226015, 49457.752711237656, 49475.0, 49501.75249123731, 49607.503924960285, 361182.0, 361423.0, 362292.82803790347, 363006.0, 363169.0, 27060.1881943542, 27592.448151037268, 27848.025319113734, 29376.26559336034, 39729.60270397259, 46584.301235480816, 46732.766336168104, 46879.53120468888, 47189.764051179525, 48063.75968120137, 38598.22803543969, 38832.20436423671, 39066.609333907436, 40200.39699404453, 40717.59282407138, 38897.80551097226, 39140.21719565536, 39598.40602391024, 39789.20421591494, 40678.0, 38591.03522411962, 40423.1915361697, 41467.58532414637, 41571.792141040314, 41753.58246417497, 31259.53110703296, 35198.648013520564, 35279.29441411209, 35978.8201058993, 35996.82001589975, 26755.19734407971, 27051.86474067617, 27254.591181132695, 27389.31526711848, 27585.0], "value": 19642.596062833145, "unit": "score"}, {"name": "jquery.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [373.9345614517462, 391.1531534228396, 395.2431094454121, 399.6722687396335, 419.4358587699545, 13311.933440332798, 15310.923445382772, 16781.58046048848, 18625.44123676292, 19347.903260483712, 18417.723734143965, 18504.814951850476, 19019.809801901978, 19022.809771902277, 19034.428967131007, 5418.322709661293, 5664.26364572605, 5665.1785491103765, 5665.915011274834, 5669.0646043402785, 3839.6352346527037, 4011.2779699654197, 5476.0, 5512.614117011811, 5756.539476841864, 5711.314642242936, 5756.222909907172, 5794.39158888317, 5799.246098007253, 5805.0, 5616.438356164392, 5701.971490142564, 5735.541156707495, 5747.655140691572, 5813.505852002585, 5567.164925261202, 5571.4428557144365, 5573.191887176336, 5575.303087114111, 5595.832125036255, 13387.0, 17192.57018574533, 19614.607707845764, 22223.333300001024, 22462.663060054114, 2264.682944387787, 2291.9083236670513, 2464.6179842124498, 2547.8726063696927, 2645.6957449893125, 8186.140455252173, 9171.58727857248, 9663.71008869728, 10108.94945525275, 10191.643292484727, 1825.6896327624204, 1872.4757068020976, 1885.7359969604267, 1895.5545446819986, 2002.6181934465174, 68945.65527172382, 74433.25566744317, 77375.6131219346, 78878.0, 79113.20886791173, 10678.252522323362, 10695.35827850316, 10696.197785166143, 10983.39591322485, 11100.833487497694, 15376.923115384352, 15387.61530961735, 15394.846051539565, 15397.692046159014, 15402.768958465633, 7683.0, 7824.178461261599, 7853.960730196312, 8017.478863873829, 8021.074942013991, 7416.22129676387, 7417.554946703215, 7428.625704244732, 7620.8475830484185, 7634.312911837961, 4393.297072468454, 4547.931781023287, 4575.24508456101, 4585.151746926829, 4746.833860814855, 1812.2479171143827, 1875.0999520230093, 1943.8542109341856, 1994.9401517954484, 2019.5657933544358, 840.8402403543307, 909.8308673354708, 937.5312343828086, 991.8809742830906, 993.0913214408879, 17728.37950671746, 18931.0, 19022.429327120208, 19138.617227655646, 19372.2251109954, 907.4827348411474, 948.2556193388157, 964.7298756348234, 1012.71643939697, 1015.081351377005, 10384.948075259575, 10658.369831749402, 10661.733456663645, 10679.765961039882, 10793.136549076213, 410922.0, 419061.0, 420715.0, 421348.0, 421957.0, 51980.74009630003, 70909.64545177344, 70939.0, 86957.0, 88094.55952720196, 948.6679662118204, 980.6420656460341, 985.3890587835444, 995.7361299255703, 1000.4547521600745, 12525.624231273076, 16125.758113628539, 17181.91409042947, 17192.140392980553, 17512.211950462515, 38474.45934191138, 39505.209895801345, 39858.0, 40466.1906761869, 40484.0, 48937.265941011625, 51076.23385649144, 55160.0, 57381.0, 57432.42567574271, 7574.545527268161, 7795.844083118192, 7859.410544209093, 7967.681292748225, 8127.187281271826, 11273.323600583992, 12110.091743119125, 12388.876111238773, 12401.069919756235, 12771.489140434278, 10751.946240269062, 10778.946105269424, 10834.187435942178, 11099.50052247667, 11516.82724759146, 10874.184436167478, 11105.888941110808, 11144.442777861237, 11221.326720396803, 11750.059995200534, 11065.778684426105, 11207.775844483227, 11280.153988451064, 11319.490622921823, 11400.543978241109, 7768.728094516665, 7940.960295198487, 7983.800404989689, 8182.549959752271, 8524.616392262238, 9631.0, 11203.271787333797, 11320.37737924422, 11482.253653512495, 11897.345645989553], "value": 8742.468707144364, "unit": "score"}, {"name": "mootools.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [1447.3993292783491, 1467.919264440456, 1580.2888700084964, 1674.631581052168, 1740.3647668600966, 7534.510256833302, 7710.421718371131, 8004.439689221749, 8607.569621518922, 8611.354148438877, 7965.800854978628, 8303.75088747337, 8315.293200077986, 8504.19210175034, 8508.702195423162, 2246.2362796649136, 2277.6128058230142, 2287.542491501698, 2288.828337874658, 2291.186628746796, 1998.2406685459578, 2066.431731273904, 2285.5771682238756, 2334.509752951882, 2339.578875802355, 2204.2395373596164, 2270.386995511211, 2271.3640180749417, 2277.7038984931937, 2285.5428914217223, 2240.7535171131162, 2290.610596198642, 2293.942651433711, 2315.7568455312116, 2324.7094113235844, 2277.6355783074628, 2283.931482055541, 2302.021640802669, 2305.043406986099, 2310.4916918277954, 8443.57782110892, 8605.526696031715, 8609.31125509964, 8609.440386374928, 8611.784705382353, 5031.974840125813, 5175.120229560984, 5184.0, 5184.377874655028, 5186.507281808223, 3296.47256438971, 3385.25524384635, 3401.3027329397414, 3449.910907248708, 3474.7567670263093, 1071.2929466552116, 1075.2150929821196, 1093.2675107677876, 1111.5942680921405, 1135.5117299561186, 11632.069434445224, 11691.415429228504, 11708.473118709679, 11708.590199342982, 11709.297442153413, 4305.634021108241, 4470.329450582439, 4524.366588677588, 4534.2745160774775, 4647.488776234612, 9804.460754658563, 9815.656452024288, 9827.606895724091, 9830.311878168603, 9833.655822046194, 5118.923216151761, 5122.795088196431, 5126.6923984561045, 5129.230615407719, 5130.666506677054, 4557.407537020166, 4708.882277943078, 4710.3405523226775, 4735.692180008357, 4780.593649539758, 3648.8175591220333, 3739.3082279778328, 3751.962480375216, 3789.8484060637816, 3816.885493435201, 1157.7626586549904, 1186.0689358853258, 1222.1628184693514, 1285.8521270053877, 1287.2212311551377, 908.2824568590739, 958.075457183821, 958.2621381536178, 962.3985009369144, 963.2438535749403, 5704.686242256716, 5851.531877449794, 5897.941020589825, 5911.201987731687, 6036.685162268922, 920.3327587499143, 947.4788866123605, 963.2534785541261, 968.665810295461, 977.8826540815147, 4035.6771458283265, 4038.2932986727205, 4042.211768705133, 4055.128147448254, 4070.4504891839815, 10285.948570257251, 10566.154707623371, 10648.0, 10664.946675266574, 10666.14670826332, 10111.544980475895, 10279.331843430153, 10580.047795698423, 10591.046805787517, 10610.0, 7747.636970723984, 7809.258120478546, 7810.804729881685, 7811.531308121531, 7814.296713295717, 5360.892782144413, 5377.704226267437, 5419.268398766116, 5526.143447765603, 5570.972145139248, 9338.066193380608, 9353.766155845886, 9474.289428292768, 9514.33399662017, 9655.662051828152, 9683.080107389787, 9730.0, 9801.509924503604, 9838.901610984085, 9895.0, 7252.166000909963, 7489.0, 7494.175640679412, 7568.3945284378215, 7581.696732130874, 8146.2261085196815, 8314.916850831414, 8319.750407487785, 8323.084460709439, 8330.833383332421, 7039.190493093155, 7118.394936430462, 7170.139583250043, 7195.13658361, 7520.09758828944, 7077.5753454792875, 7135.357817796424, 7216.097987751531, 7249.130104387507, 7301.926980730124, 6670.633115178518, 6810.387065164159, 6816.863662726817, 6820.693068811816, 6823.454123670193, 4838.564529192389, 4873.220284754422, 4921.827736029221, 4957.355543779286, 5045.62157838171, 4913.77887995034, 5058.519440653132, 5132.204508301219, 5143.948560514496, 5207.895842083213], "value": 4493.017177141836, "unit": "score"}, {"name": "prototype.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [318.697237624257, 325.89734233716376, 329.67526985918863, 330.1021222275413, 332.5394328854537, 5330.653507522008, 5372.862895570408, 5431.83704488865, 5437.700926449049, 5447.564194864412, 5230.300152450459, 5269.6311258211945, 5301.973490132554, 5324.600654950875, 5335.359756829176, 3917.78452185129, 4008.859689910854, 4019.1358857845557, 4083.4895638045246, 4131.690123240754, 4110.77390743509, 4119.8352065917325, 4119.876403707878, 4125.504939407276, 4126.46355973723, 4055.0065234017707, 4086.284900142478, 4088.7342322748927, 4098.364753463203, 4128.339465685491, 3931.8820435386983, 4030.0932290234755, 4049.75701457912, 4095.344744840811, 4119.629233369011, 3643.3806252937065, 3646.5806432260365, 3647.379945409287, 3647.960331305565, 3654.707623390149, 5141.948580514222, 5160.277561141405, 5163.406208286057, 5182.119039763249, 5204.76578553966, 4624.838130665445, 4675.672702910798, 4717.952820471785, 4726.692764970266, 4736.147493451177, 5466.781328746845, 5470.206820011116, 5480.314960629921, 5494.890102197934, 5497.505224529771, 4028.650402115295, 4029.5164580250557, 4033.3949907513816, 4061.79691015451, 4069.7558146511305, 5663.405342439067, 5681.431856814327, 5719.14212868069, 5745.511631511326, 5848.572842270495, 4061.0, 4075.0, 4079.3880917862557, 4086.325756250245, 4088.7137900347284, 4130.607592278789, 4134.152498737752, 4145.626893579592, 4168.83272683643, 4170.311898536768, 4575.2450845610765, 4684.180268453007, 4723.456802467692, 4728.243481043017, 4732.266498692708, 5505.256790333254, 5513.030617955066, 5513.476219759116, 5514.365847927459, 5515.310586176728, 1385.1758203868683, 1386.2514242309242, 1387.3202130955758, 1393.7630602797549, 1401.341369556307, 919.5540163020929, 929.9491574520883, 975.3075316525204, 979.9167070798919, 997.0, 5027.069992051483, 5259.158534634516, 5398.541124004425, 5403.675779453245, 5405.621606487508, 5701.2018317435595, 5701.743421546041, 5730.770769169187, 5733.799317023884, 5743.8564035899435, 5252.29094072303, 5365.38298095724, 5395.757190926418, 5397.4062853086125, 5417.214503896913, 2904.143277733074, 2907.3458471844087, 2912.7087291271127, 2916.824990500577, 2925.663548691885, 5608.747606357723, 5645.774169033275, 5651.378348381675, 5683.403242659461, 5686.886262274731, 5367.865803354947, 5584.525315348241, 5607.186957891165, 5631.80288689902, 5667.404922483162, 5576.721163941867, 5628.718564071698, 5638.746256418389, 5646.604737668324, 5655.434456554394, 5281.339832520935, 5426.213199086189, 5446.264754258124, 5471.6169868108855, 5548.722563871871, 5462.289902312674, 5468.894475626833, 5475.370332411664, 5476.561875050066, 5494.917576236279, 5637.49262566371, 5662.292213473316, 5671.574631902541, 5672.801451949162, 5696.604331938702, 3830.9808450957566, 3998.7600743955454, 4015.257177422186, 4024.315866302794, 4040.0, 5444.733160103906, 5456.072467680425, 5459.535939445192, 5493.835184944458, 5497.422770609029, 5242.501962313574, 5291.232771248225, 5295.816305118913, 5384.300040994645, 5395.3525576931015, 5092.337996060489, 5284.524392804666, 5302.700838294642, 5323.429588271391, 5330.9733451332495, 5219.164933610604, 5229.660072095302, 5230.241614965885, 5238.397584277857, 5241.528262456397, 5281.313429254326, 5458.062387852256, 5467.808626698046, 5595.692236927008, 5608.747606357642, 5426.972865135649, 5463.125899856004, 5483.643563168382, 5485.670859748428, 5486.396496385474], "value": 4180.1784169595885, "unit": "score"}, {"name": "yui.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [723.7286017743346, 747.7382915979405, 771.1324759645398, 791.774344311871, 816.3795515408287, 13800.240986745725, 14685.33915973781, 14686.559403217894, 14709.0, 14719.190444525548, 13651.385687644055, 13814.65463363414, 13816.930915345434, 13816.930915345434, 13818.861811381908, 652.8890088684935, 671.4091599392527, 771.3636250093667, 775.2402645407504, 789.928906398424, 783.8941742864697, 793.5119901260712, 793.714262865368, 793.8412317536515, 794.6106407860165, 833.0212000898949, 833.1335411172404, 833.4291010657688, 835.0480452284401, 837.0374069819695, 689.3382352941182, 700.817787375281, 792.2434075457924, 823.3372135430976, 824.5258976088743, 592.2567178191342, 600.6096037575611, 600.7026521871702, 601.3475379213559, 602.8854517641633, 13319.200847949058, 13343.199408035549, 13361.064725469221, 13365.198088114646, 13374.933125334408, 13018.739625207538, 13055.543055992996, 13236.338183090904, 13290.136141150795, 13323.733525329537, 11850.051995840313, 11918.284902905767, 12187.268763874195, 12220.633380998584, 12653.873461265453, 3961.267165574378, 4126.133511962462, 4250.447441832542, 4358.716683415568, 4374.890627734332, 63524.364756352305, 64815.67592162056, 65279.673601631686, 65340.34659653438, 66503.99999999952, 10797.676069717763, 10811.0, 10896.61861834832, 11046.668599942015, 11157.609483668033, 17612.383566575107, 18530.351437699617, 19906.90046549758, 19975.300864469675, 20144.39566812998, 7798.298153166129, 7849.411294152847, 7951.324137448381, 8116.675332986614, 8119.83760324802, 4361.520232774392, 4473.642108631302, 4560.612347950461, 4566.360709500673, 4670.346151538787, 3418.8974330770116, 3489.5812502499357, 3526.20660351424, 3527.735419843522, 3531.752777305564, 602.4728362682653, 608.9177960975301, 614.0, 619.6994457688018, 625.4652272307203, 613.5980932489226, 638.8147437243148, 709.9645017749092, 719.5567371481084, 743.1528058013869, 8797.29621630268, 8912.287017038621, 9329.72010839676, 9393.342466027312, 9501.23990080792, 695.6417445015821, 698.7135274537517, 704.8731228378839, 732.4287056096254, 735.6873328835223, 4323.589259020388, 4567.086582683477, 4581.679282450196, 4617.464554373053, 4639.536046395334, 81002.0, 81096.18903811004, 83964.58017709872, 85269.14730852736, 86972.0, 46805.0, 55969.720151398986, 72236.63881680663, 73536.63231683808, 76062.0, 54479.455205448234, 59681.0, 61117.0, 61615.38384616186, 63406.0, 9380.624775009197, 9513.762155946157, 10009.299349045497, 10014.64948726791, 10020.799584008133, 42780.78609606932, 43961.0, 44461.0, 44659.55340446684, 45509.77245113886, 50285.49714502808, 51645.7417712909, 52380.0, 57152.42847571638, 57410.0, 12000.099992500773, 12093.879061209274, 12228.327441990776, 12397.690057748629, 12739.171953822972, 14000.719985600435, 14181.503647372705, 14293.499727509487, 14294.499692510712, 14768.63078423048, 12754.170978886343, 12819.294938778085, 13005.934970325088, 13610.053084605353, 13618.455261789417, 12508.437120329425, 12600.684982875502, 12833.743325133632, 13011.934940325238, 13932.233727145105, 12649.757364567835, 12796.680082998, 12830.935845320713, 13036.217826930415, 13055.608331750063, 9944.850827237742, 10075.395476271447, 10378.42918639482, 10686.946565267124, 10863.891361086287, 10148.289619726549, 10679.305845120043, 11131.499082541468, 11177.497012634289, 11252.437378131224], "value": 6967.9116371890805, "unit": "score"}], "name": "dromaeo_css", "value": 7010.727677881412, "alertThreshold": 5.0}, {"lowerIsBetter": true, "subtests": [{"name": "ai-astar", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [104.0, 111.0, 110.0, 112.0, 112.0, 112.0, 111.0, 112.0, 111.0, 112.0], "value": 110.7, "unit": "score"}, {"name": "audio-beat-detection", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [158.0, 126.0, 124.0, 158.0, 125.0, 127.0, 127.0, 124.0, 149.0, 125.0], "value": 134.3, "unit": "score"}, {"name": "audio-dft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [160.0, 160.0, 161.0, 163.0, 163.0, 165.0, 163.0, 162.0, 161.0, 161.0], "value": 161.9, "unit": "score"}, {"name": "audio-fft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [76.0, 76.0, 75.0, 107.0, 77.0, 76.0, 76.0, 76.0, 100.0, 76.0], "value": 81.5, "unit": "score"}, {"name": "audio-oscillator", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [83.0, 83.0, 116.0, 82.0, 82.0, 81.0, 105.0, 83.0, 84.0, 112.0], "value": 91.1, "unit": "score"}, {"name": "imaging-gaussian-blur", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [117.0, 117.0, 116.0, 117.0, 117.0, 117.0, 117.0, 117.0, 117.0, 117.0], "value": 116.9, "unit": "score"}, {"name": "imaging-darkroom", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [146.0, 146.0, 146.0, 146.0, 146.0, 146.0, 146.0, 146.0, 146.0, 146.0], "value": 146.0, "unit": "score"}, {"name": "imaging-desaturate", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [95.0, 95.0, 95.0, 95.0, 96.0, 95.0, 95.0, 96.0, 96.0, 97.0], "value": 95.5, "unit": "score"}, {"name": "json-parse-financial", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [52.0, 52.0, 50.0, 51.0, 53.0, 54.0, 53.0, 52.0, 52.0, 51.0], "value": 52.0, "unit": "score"}, {"name": "json-stringify-tinderbox", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [62.0, 61.0, 61.0, 62.0, 62.0, 62.0, 62.0, 62.0, 62.0, 62.0], "value": 61.8, "unit": "score"}, {"name": "stanford-crypto-aes", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [82.0, 81.0, 80.0, 81.0, 81.0, 82.0, 81.0, 81.0, 81.0, 82.0], "value": 81.2, "unit": "score"}, {"name": "stanford-crypto-ccm", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [140.0, 144.0, 134.0, 148.0, 140.0, 135.0, 141.0, 141.0, 191.0, 130.0], "value": 144.4, "unit": "score"}, {"name": "stanford-crypto-pbkdf2", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [169.0, 168.0, 167.0, 164.0, 165.0, 163.0, 170.0, 165.0, 167.0, 166.0], "value": 166.4, "unit": "score"}, {"name": "stanford-crypto-sha256-iterative", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [67.0, 67.0, 65.0, 64.0, 66.0, 65.0, 66.0, 66.0, 69.0, 65.0], "value": 66.0, "unit": "score"}], "name": "kraken", "value": 1509.7000000000003, "alertThreshold": 2.0}]} 03:39:21 INFO - Return code: 0 03:39:21 INFO - Validating PERFHERDER_DATA against /builds/slave/test/scripts/external_tools/performance-artifact-schema.json 03:39:21 INFO - # TBPL SUCCESS # 03:39:21 INFO - Running post-action listener: _resource_record_post_action 03:39:21 INFO - [mozharness: 2016-11-24 11:39:21.317262Z] Finished run-tests step (success) 03:39:21 INFO - Running post-run listener: _resource_record_post_run 03:39:21 INFO - Total resource usage - Wall time: 1198s; CPU: 13.0%; Read bytes: 4096; Write bytes: 392175616; Read time: 8; Write time: 226280 03:39:21 INFO - TinderboxPrint: CPU usage
13.1% 03:39:21 INFO - TinderboxPrint: I/O read bytes / time
4,096 / 8 03:39:21 INFO - TinderboxPrint: I/O write bytes / time
392,175,616 / 226,280 03:39:21 INFO - TinderboxPrint: CPU idle
8,301.8 (86.8%) 03:39:21 INFO - TinderboxPrint: CPU user
1,205.8 (12.6%) 03:39:21 INFO - TinderboxPrint: Swap in / out
0 / 0 03:39:21 INFO - install - Wall time: 17s; CPU: 13.0%; Read bytes: 0; Write bytes: 103931904; Read time: 0; Write time: 75528 03:39:21 INFO - run-tests - Wall time: 1181s; CPU: 13.0%; Read bytes: 0; Write bytes: 288243712; Read time: 0; Write time: 150752 03:39:21 INFO - Running post-run listener: _upload_blobber_files 03:39:21 INFO - Blob upload gear active. 03:39:21 INFO - Preparing to upload files from /builds/slave/test/build/blobber_upload_dir. 03:39:21 INFO - Files from /builds/slave/test/build/blobber_upload_dir are to be uploaded with branch at the following location(s): https://blobupload.elasticbeanstalk.com 03:39:21 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/venv/bin/blobberc.py', '-u', 'https://blobupload.elasticbeanstalk.com', '-a', '/builds/slave/test/oauth.txt', '-b', 'Mozilla-Inbound', '-d', '/builds/slave/test/build/blobber_upload_dir', '--output-manifest', '/builds/slave/test/build/uploaded_files.json'] 03:39:21 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/venv/bin/blobberc.py -u https://blobupload.elasticbeanstalk.com -a /builds/slave/test/oauth.txt -b Mozilla-Inbound -d /builds/slave/test/build/blobber_upload_dir --output-manifest /builds/slave/test/build/uploaded_files.json 03:39:22 INFO - (blobuploader) - INFO - Open directory for files ... 03:39:22 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log ... 03:39:22 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 03:39:22 INFO - (blobuploader) - INFO - Uploading, attempt #1. 03:39:23 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs_errorsummary.log: uploaded 03:39:23 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 03:39:23 INFO - (blobuploader) - INFO - Done attempting. 03:39:23 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/resource-usage.json ... 03:39:23 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 03:39:23 INFO - (blobuploader) - INFO - Uploading, attempt #1. 03:39:27 INFO - (blobuploader) - INFO - TinderboxPrint: resource-usage.json: uploaded 03:39:27 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 03:39:27 INFO - (blobuploader) - INFO - Done attempting. 03:39:27 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log ... 03:39:27 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 03:39:27 INFO - (blobuploader) - INFO - Uploading, attempt #1. 03:39:28 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs_raw.log: uploaded 03:39:28 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 03:39:28 INFO - (blobuploader) - INFO - Done attempting. 03:39:28 INFO - (blobuploader) - INFO - Iteration through files over. 03:39:28 INFO - Return code: 0 03:39:28 INFO - rmtree: /builds/slave/test/build/uploaded_files.json 03:39:28 INFO - retry: Calling remove with args: ('/builds/slave/test/build/uploaded_files.json',), kwargs: {}, attempt #1 03:39:28 INFO - Setting buildbot property blobber_files to {"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Inbound/sha512/7c6fa719a571a88b5b06014b4ff05d2569d6b42c2223e151c3ea58afe3d9ac45b66800f33be463eb67cde071885d8408eb588f3d382bec1dfaaef4a40c9dab45", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Inbound/sha512/277d2c1161ae9dfc217e6d6121beb3e0afefede4174d6c9b0912052f931926420199e16b1d1276a6b7c9f37d08cd3eb558977a0330b1224a6980ed237c9ba87e", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Inbound/sha512/0edc2c5d5594f06969f6a3f369ccc8e7b7d6c6bf0053f3af385126fab4648adec031f65754979d12bcaa2b89b5e4b64beb695f05ba8990d657f15f8664f2eea7"} 03:39:28 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test/properties/blobber_files 03:39:28 INFO - Writing to file /builds/slave/test/properties/blobber_files 03:39:28 INFO - Contents: 03:39:28 INFO - blobber_files:{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Inbound/sha512/7c6fa719a571a88b5b06014b4ff05d2569d6b42c2223e151c3ea58afe3d9ac45b66800f33be463eb67cde071885d8408eb588f3d382bec1dfaaef4a40c9dab45", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Inbound/sha512/277d2c1161ae9dfc217e6d6121beb3e0afefede4174d6c9b0912052f931926420199e16b1d1276a6b7c9f37d08cd3eb558977a0330b1224a6980ed237c9ba87e", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Inbound/sha512/0edc2c5d5594f06969f6a3f369ccc8e7b7d6c6bf0053f3af385126fab4648adec031f65754979d12bcaa2b89b5e4b64beb695f05ba8990d657f15f8664f2eea7"} 03:39:28 INFO - Running post-run listener: copy_logs_to_upload_dir 03:39:28 INFO - Copying logs to upload dir... 03:39:28 INFO - mkdir: /builds/slave/test/build/upload/logs 03:39:28 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1249.189692 ========= master_lag: 0.01 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 49 secs) (at 2016-11-24 03:39:27.898390) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-11-24 03:39:27.901765) ========= bash -c 'for file in `ls -1`; do cat $file; done' in dir /builds/slave/test/properties (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', 'for file in `ls -1`; do cat $file; done'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test/properties SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=934fc3100db09dcb9af4d4b6000001ab-1479977898.495261-576708901 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False blobber_files:{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Inbound/sha512/7c6fa719a571a88b5b06014b4ff05d2569d6b42c2223e151c3ea58afe3d9ac45b66800f33be463eb67cde071885d8408eb588f3d382bec1dfaaef4a40c9dab45", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Inbound/sha512/277d2c1161ae9dfc217e6d6121beb3e0afefede4174d6c9b0912052f931926420199e16b1d1276a6b7c9f37d08cd3eb558977a0330b1224a6980ed237c9ba87e", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Inbound/sha512/0edc2c5d5594f06969f6a3f369ccc8e7b7d6c6bf0053f3af385126fab4648adec031f65754979d12bcaa2b89b5e4b64beb695f05ba8990d657f15f8664f2eea7"} build_url:https://archive.mozilla.org/pub/firefox/tinderbox-builds/mozilla-inbound-linux64-pgo/1479976410/firefox-53.0a1.en-US.linux-x86_64.tar.bz2 program finished with exit code 0 elapsedTime=0.011910 build_url: 'https://archive.mozilla.org/pub/firefox/tinderbox-builds/mozilla-inbound-linux64-pgo/1479976410/firefox-53.0a1.en-US.linux-x86_64.tar.bz2' blobber_files: '{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Inbound/sha512/7c6fa719a571a88b5b06014b4ff05d2569d6b42c2223e151c3ea58afe3d9ac45b66800f33be463eb67cde071885d8408eb588f3d382bec1dfaaef4a40c9dab45", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Inbound/sha512/277d2c1161ae9dfc217e6d6121beb3e0afefede4174d6c9b0912052f931926420199e16b1d1276a6b7c9f37d08cd3eb558977a0330b1224a6980ed237c9ba87e", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Inbound/sha512/0edc2c5d5594f06969f6a3f369ccc8e7b7d6c6bf0053f3af385126fab4648adec031f65754979d12bcaa2b89b5e4b64beb695f05ba8990d657f15f8664f2eea7"}' ========= master_lag: 0.01 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-11-24 03:39:27.927659) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-11-24 03:39:27.928059) ========= rm -f oauth.txt in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['rm', '-f', 'oauth.txt'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=934fc3100db09dcb9af4d4b6000001ab-1479977898.495261-576708901 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004528 ========= master_lag: 0.08 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-11-24 03:39:28.013115) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2016-11-24 03:39:28.013440) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2016-11-24 03:39:28.013725) ========= ========= Total master_lag: 0.18 =========