builder: mozilla-central_ubuntu64_hw_test-dromaeojs-e10s slave: talos-linux64-ix-035 starttime: 1452824435.61 results: success (0) buildid: 20160114165541 builduid: 212b9bfea5714af5aae64e6056cb091f revision: 9a358be6fa798f24deecac1b502742b2c37cd6bd ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2016-01-14 18:20:35.612548) ========= master: http://buildbot-master104.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2016-01-14 18:20:35.612963) ========= ========= Started set props: basedir (results: 0, elapsed: 0 secs) (at 2016-01-14 18:20:35.613249) ========= bash -c pwd in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', 'pwd'] 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=ed14279e38b05397cf4aa391000001a4-1452821364.736606-2006632967 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False /builds/slave/test program finished with exit code 0 elapsedTime=0.006328 basedir: '/builds/slave/test' ========= master_lag: 0.02 ========= ========= Finished set props: basedir (results: 0, elapsed: 0 secs) (at 2016-01-14 18:20:35.640900) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-01-14 18:20:35.641275) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-01-14 18:20:35.663456) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-01-14 18:20:35.663735) ========= rm -rf properties in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['rm', '-rf', '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=ed14279e38b05397cf4aa391000001a4-1452821364.736606-2006632967 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004628 ========= master_lag: 0.05 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-01-14 18:20:35.715896) ========= ========= Started set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2016-01-14 18:20:35.716158) ========= script_repo_url: https://hg.mozilla.org/build/mozharness ========= Finished set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2016-01-14 18:20:35.716502) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-01-14 18:20:35.716801) ========= 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=ed14279e38b05397cf4aa391000001a4-1452821364.736606-2006632967 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2016-01-14 18:20:35-- 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: 12141 (12K) [text/x-python] Saving to: `archiver_client.py' 0K .......... . 100% 84.5M=0s 2016-01-14 18:20:35 (84.5 MB/s) - `archiver_client.py' saved [12141/12141] program finished with exit code 0 elapsedTime=0.100402 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-01-14 18:20:35.834020) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-01-14 18:20:35.834541) ========= rm -rf scripts in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['rm', '-rf', 'scripts'] 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=ed14279e38b05397cf4aa391000001a4-1452821364.736606-2006632967 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.019004 ========= master_lag: 0.03 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-01-14 18:20:35.887371) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-01-14 18:20:35.888274) ========= bash -c 'python archiver_client.py mozharness --repo mozilla-central --rev 9a358be6fa798f24deecac1b502742b2c37cd6bd --destination scripts --debug' in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', u'python archiver_client.py mozharness --repo mozilla-central --rev 9a358be6fa798f24deecac1b502742b2c37cd6bd --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=ed14279e38b05397cf4aa391000001a4-1452821364.736606-2006632967 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2016-01-14 18:20:36,013 truncating revision to first 12 chars 2016-01-14 18:20:36,013 Setting DEBUG logging. 2016-01-14 18:20:36,013 attempt 1/10 2016-01-14 18:20:36,013 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/mozilla-central/9a358be6fa79?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2016-01-14 18:20:36,492 unpacking tar archive at: mozilla-central-9a358be6fa79/testing/mozharness/ program finished with exit code 0 elapsedTime=0.808859 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-01-14 18:20:36.718114) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-01-14 18:20:36.718925) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-01-14 18:20:36.730805) ========= ========= Started tinderboxprint_script_revlink (results: 0, elapsed: 0 secs) (at 2016-01-14 18:20:36.731112) ========= TinderboxPrint: script_revlink: https://hg.mozilla.org/build/mozharness/rev/production ========= Finished tinderboxprint_script_revlink (results: 0, elapsed: 0 secs) (at 2016-01-14 18:20:36.731560) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 21 mins, 16 secs) (at 2016-01-14 18:20:36.731939) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Firefox-Non-PGO --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Firefox-Non-PGO 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-e10s', '--add-option', '--webServer,localhost', '--branch-name', 'Firefox-Non-PGO', '--cfg', 'talos/linux_config.py', '--download-symbols', 'ondemand', '--use-talos-json', '--blob-upload-branch', 'Firefox-Non-PGO'] 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=ed14279e38b05397cf4aa391000001a4-1452821364.736606-2006632967 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 18:20:36 INFO - MultiFileLogger online at 20160114 18:20:36 in /builds/slave/test 18:20:36 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Firefox-Non-PGO --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Firefox-Non-PGO 18:20:36 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 18:20:36 INFO - {'append_to_log': False, 18:20:36 INFO - 'base_work_dir': '/builds/slave/test', 18:20:36 INFO - 'blob_upload_branch': 'Firefox-Non-PGO', 18:20:36 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 18:20:36 INFO - 'branch': 'Firefox-Non-PGO', 18:20:36 INFO - 'buildbot_json_path': 'buildprops.json', 18:20:36 INFO - 'config_files': ('talos/linux_config.py',), 18:20:36 INFO - 'default_actions': ('clobber', 18:20:36 INFO - 'read-buildbot-config', 18:20:36 INFO - 'download-and-extract', 18:20:36 INFO - 'populate-webroot', 18:20:36 INFO - 'create-virtualenv', 18:20:36 INFO - 'install', 18:20:36 INFO - 'run-tests'), 18:20:36 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 18:20:36 INFO - 'download_minidump_stackwalk': True, 18:20:36 INFO - 'download_symbols': 'ondemand', 18:20:36 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 18:20:36 INFO - 'tooltool.py': '/tools/tooltool.py', 18:20:36 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 18:20:36 INFO - '/tools/misc-python/virtualenv.py')}, 18:20:36 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 18:20:36 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 18:20:36 INFO - 'installer_path': 'installer.exe', 18:20:36 INFO - 'log_level': 'info', 18:20:36 INFO - 'log_name': 'talos', 18:20:36 INFO - 'log_to_console': True, 18:20:36 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 18:20:36 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 18:20:36 INFO - 'opt_config_files': (), 18:20:36 INFO - 'pip_index': False, 18:20:36 INFO - 'sps_profile': False, 18:20:36 INFO - 'sps_profile_interval': 0, 18:20:36 INFO - 'suite': 'dromaeojs-e10s', 18:20:36 INFO - 'system_bits': '32', 18:20:36 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 18:20:36 INFO - 'title': 'talos-linux64-ix-035', 18:20:36 INFO - 'tooltool_cache': '/builds/tooltool_cache', 18:20:36 INFO - 'use_talos_json': True, 18:20:36 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 18:20:36 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 18:20:36 INFO - 'work_dir': 'build'} 18:20:36 INFO - ##### 18:20:36 INFO - ##### Running clobber step. 18:20:36 INFO - ##### 18:20:36 INFO - Running pre-action listener: _resource_record_pre_action 18:20:36 INFO - Running main action method: clobber 18:20:36 INFO - rmtree: /builds/slave/test/build 18:20:36 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 18:20:37 INFO - Running post-action listener: _resource_record_post_action 18:20:37 INFO - ##### 18:20:37 INFO - ##### Running read-buildbot-config step. 18:20:37 INFO - ##### 18:20:37 INFO - Running pre-action listener: _resource_record_pre_action 18:20:37 INFO - Running main action method: read_buildbot_config 18:20:37 INFO - Using buildbot properties: 18:20:37 INFO - { 18:20:37 INFO - "project": "", 18:20:37 INFO - "product": "firefox", 18:20:37 INFO - "script_repo_revision": "production", 18:20:37 INFO - "builddir": "mozilla-central_ubuntu64_hw_test-dromaeojs-e10s", 18:20:37 INFO - "repository": "", 18:20:37 INFO - "buildername": "Ubuntu HW 12.04 x64 mozilla-central talos dromaeojs-e10s", 18:20:37 INFO - "buildid": "20160114165541", 18:20:37 INFO - "pgo_build": "False", 18:20:37 INFO - "basedir": "/builds/slave/test", 18:20:37 INFO - "buildnumber": 173, 18:20:37 INFO - "slavename": "talos-linux64-ix-035", 18:20:37 INFO - "master": "http://buildbot-master104.bb.releng.scl3.mozilla.com:8201/", 18:20:37 INFO - "platform": "ubuntu64_hw", 18:20:37 INFO - "scheduler": "tests-mozilla-central-linux64-talos", 18:20:37 INFO - "branch": "mozilla-central", 18:20:37 INFO - "repo_path": "mozilla-central", 18:20:37 INFO - "revision": "9a358be6fa798f24deecac1b502742b2c37cd6bd", 18:20:37 INFO - "stage_platform": "linux64", 18:20:37 INFO - "builduid": "212b9bfea5714af5aae64e6056cb091f", 18:20:37 INFO - "slavebuilddir": "test" 18:20:37 INFO - } 18:20:37 INFO - Found installer url https://queue.taskcluster.net/v1/task/EIKdsMZ6RPmyPTx6I7Y_yA/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.tar.bz2. 18:20:37 INFO - Running post-action listener: _resource_record_post_action 18:20:37 INFO - ##### 18:20:37 INFO - ##### Running download-and-extract step. 18:20:37 INFO - ##### 18:20:37 INFO - Running pre-action listener: _resource_record_pre_action 18:20:37 INFO - Running main action method: download_and_extract 18:20:37 INFO - mkdir: /builds/slave/test/build/tests 18:20:37 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://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 18:20:37 INFO - https://queue.taskcluster.net/v1/task/EIKdsMZ6RPmyPTx6I7Y_yA/artifacts/public/build/test_packages.json matches https://queue.taskcluster.net 18:20:37 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/EIKdsMZ6RPmyPTx6I7Y_yA/artifacts/public/build/test_packages.json 18:20:37 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/EIKdsMZ6RPmyPTx6I7Y_yA/artifacts/public/build/test_packages.json 18:20:37 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/EIKdsMZ6RPmyPTx6I7Y_yA/artifacts/public/build/test_packages.json to /builds/slave/test/build/test_packages.json 18:20:37 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/EIKdsMZ6RPmyPTx6I7Y_yA/artifacts/public/build/test_packages.json', 'file_name': '/builds/slave/test/build/test_packages.json'}, attempt #1 18:20:39 INFO - Downloaded 1448 bytes. 18:20:39 INFO - Reading from file /builds/slave/test/build/test_packages.json 18:20:39 INFO - Using the following test package requirements: 18:20:39 INFO - {u'common': [u'firefox-46.0a1.en-US.linux-x86_64.common.tests.zip'], 18:20:39 INFO - u'cppunittest': [u'firefox-46.0a1.en-US.linux-x86_64.common.tests.zip', 18:20:39 INFO - u'firefox-46.0a1.en-US.linux-x86_64.cppunittest.tests.zip'], 18:20:39 INFO - u'gtest': [u'firefox-46.0a1.en-US.linux-x86_64.common.tests.zip', 18:20:39 INFO - u'firefox-46.0a1.en-US.linux-x86_64.gtest.tests.zip'], 18:20:39 INFO - u'jittest': [u'firefox-46.0a1.en-US.linux-x86_64.common.tests.zip', 18:20:39 INFO - u'jsshell-linux-x86_64.zip'], 18:20:39 INFO - u'mochitest': [u'firefox-46.0a1.en-US.linux-x86_64.common.tests.zip', 18:20:39 INFO - u'firefox-46.0a1.en-US.linux-x86_64.mochitest.tests.zip'], 18:20:39 INFO - u'mozbase': [u'firefox-46.0a1.en-US.linux-x86_64.common.tests.zip'], 18:20:39 INFO - u'reftest': [u'firefox-46.0a1.en-US.linux-x86_64.common.tests.zip', 18:20:39 INFO - u'firefox-46.0a1.en-US.linux-x86_64.reftest.tests.zip'], 18:20:39 INFO - u'talos': [u'firefox-46.0a1.en-US.linux-x86_64.common.tests.zip', 18:20:39 INFO - u'firefox-46.0a1.en-US.linux-x86_64.talos.tests.zip'], 18:20:39 INFO - u'web-platform': [u'firefox-46.0a1.en-US.linux-x86_64.common.tests.zip', 18:20:39 INFO - u'firefox-46.0a1.en-US.linux-x86_64.web-platform.tests.zip'], 18:20:39 INFO - u'webapprt': [u'firefox-46.0a1.en-US.linux-x86_64.common.tests.zip'], 18:20:39 INFO - u'xpcshell': [u'firefox-46.0a1.en-US.linux-x86_64.common.tests.zip', 18:20:39 INFO - u'firefox-46.0a1.en-US.linux-x86_64.xpcshell.tests.zip']} 18:20:39 INFO - Downloading packages: [u'firefox-46.0a1.en-US.linux-x86_64.common.tests.zip'] for test suite category: common 18:20: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://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 18:20:39 INFO - https://queue.taskcluster.net/v1/task/EIKdsMZ6RPmyPTx6I7Y_yA/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 18:20:39 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/EIKdsMZ6RPmyPTx6I7Y_yA/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip 18:20:39 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/EIKdsMZ6RPmyPTx6I7Y_yA/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip 18:20:39 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/EIKdsMZ6RPmyPTx6I7Y_yA/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip to /builds/slave/test/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip 18:20:39 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/EIKdsMZ6RPmyPTx6I7Y_yA/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip'}, attempt #1 18:20:41 INFO - Downloaded 22762240 bytes. 18:20:41 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip', '-d', '/builds/slave/test/build/tests'] 18:20:41 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip -d /builds/slave/test/build/tests 18:20:42 INFO - Return code: 0 18:20:42 INFO - Downloading packages: [u'firefox-46.0a1.en-US.linux-x86_64.common.tests.zip', u'firefox-46.0a1.en-US.linux-x86_64.talos.tests.zip'] for test suite category: talos 18:20:42 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://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 18:20:42 INFO - https://queue.taskcluster.net/v1/task/EIKdsMZ6RPmyPTx6I7Y_yA/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 18:20:42 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/EIKdsMZ6RPmyPTx6I7Y_yA/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip 18:20:42 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/EIKdsMZ6RPmyPTx6I7Y_yA/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip 18:20:42 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/EIKdsMZ6RPmyPTx6I7Y_yA/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip to /builds/slave/test/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip 18:20:42 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/EIKdsMZ6RPmyPTx6I7Y_yA/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip'}, attempt #1 18:20:44 INFO - Downloaded 22762240 bytes. 18:20:44 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip', '-d', '/builds/slave/test/build/tests'] 18:20:44 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip -d /builds/slave/test/build/tests 18:20:46 INFO - Return code: 0 18:20:46 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://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 18:20:46 INFO - https://queue.taskcluster.net/v1/task/EIKdsMZ6RPmyPTx6I7Y_yA/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.talos.tests.zip matches https://queue.taskcluster.net 18:20:46 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/EIKdsMZ6RPmyPTx6I7Y_yA/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.talos.tests.zip 18:20:46 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/EIKdsMZ6RPmyPTx6I7Y_yA/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.talos.tests.zip 18:20:46 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/EIKdsMZ6RPmyPTx6I7Y_yA/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.talos.tests.zip to /builds/slave/test/build/firefox-46.0a1.en-US.linux-x86_64.talos.tests.zip 18:20:46 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/EIKdsMZ6RPmyPTx6I7Y_yA/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.talos.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-46.0a1.en-US.linux-x86_64.talos.tests.zip'}, attempt #1 18:20:49 INFO - Downloaded 11132144 bytes. 18:20:49 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-46.0a1.en-US.linux-x86_64.talos.tests.zip', '-d', '/builds/slave/test/build/tests'] 18:20:49 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-46.0a1.en-US.linux-x86_64.talos.tests.zip -d /builds/slave/test/build/tests 18:20:49 INFO - Return code: 0 18:20:49 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://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 18:20:49 INFO - https://queue.taskcluster.net/v1/task/EIKdsMZ6RPmyPTx6I7Y_yA/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.tar.bz2 matches https://queue.taskcluster.net 18:20:49 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/EIKdsMZ6RPmyPTx6I7Y_yA/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.tar.bz2 18:20:49 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/EIKdsMZ6RPmyPTx6I7Y_yA/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.tar.bz2 18:20:49 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/EIKdsMZ6RPmyPTx6I7Y_yA/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.tar.bz2 to /builds/slave/test/build/firefox-46.0a1.en-US.linux-x86_64.tar.bz2 18:20:49 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/EIKdsMZ6RPmyPTx6I7Y_yA/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.tar.bz2', 'file_name': '/builds/slave/test/build/firefox-46.0a1.en-US.linux-x86_64.tar.bz2'}, attempt #1 18:20:52 INFO - Downloaded 53978975 bytes. 18:20:52 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/EIKdsMZ6RPmyPTx6I7Y_yA/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.tar.bz2 18:20:52 INFO - mkdir: /builds/slave/test/properties 18:20:52 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 18:20:52 INFO - Writing to file /builds/slave/test/properties/build_url 18:20:52 INFO - Contents: 18:20:52 INFO - build_url:https://queue.taskcluster.net/v1/task/EIKdsMZ6RPmyPTx6I7Y_yA/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.tar.bz2 18:20:52 INFO - Running post-action listener: _resource_record_post_action 18:20:52 INFO - Running post-action listener: set_extra_try_arguments 18:20:52 INFO - ##### 18:20:52 INFO - ##### Running populate-webroot step. 18:20:52 INFO - ##### 18:20:52 INFO - Running pre-action listener: _resource_record_pre_action 18:20:52 INFO - Running main action method: populate_webroot 18:20:52 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 18:20:52 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 18:20:52 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 18:20:52 INFO - '--tppagecycles', 18:20:52 INFO - '7'], 18:20:52 INFO - 'tests': ['tsvgm']}}, 18:20:52 INFO - 'suites': {'chromez': {'tests': ['tresize', 'tcanvasmark']}, 18:20:52 INFO - 'chromez-e10s': {'talos_options': ['--e10s'], 18:20:52 INFO - 'tests': ['tresize', 'tcanvasmark']}, 18:20:52 INFO - 'dromaeojs': {'tests': ['dromaeo_css', 'kraken', 'v8_7']}, 18:20:52 INFO - 'dromaeojs-e10s': {'talos_options': ['--e10s'], 18:20:52 INFO - 'tests': ['dromaeo_css', 'kraken', 'v8_7']}, 18:20:52 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 18:20:52 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 18:20:52 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 18:20:52 INFO - 'talos_options': ['--e10s'], 18:20:52 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 18:20:52 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 18:20:52 INFO - 'tests': ['damp', 'tps']}, 18:20:52 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 18:20:52 INFO - 'talos_options': ['--e10s'], 18:20:52 INFO - 'tests': ['damp', 'tps']}, 18:20:52 INFO - 'g3': {'tests': ['dromaeo_dom']}, 18:20:52 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 18:20:52 INFO - 'other': {'tests': ['a11yr', 18:20:52 INFO - 'ts_paint', 18:20:52 INFO - 'tpaint', 18:20:52 INFO - 'sessionrestore', 18:20:52 INFO - 'sessionrestore_no_auto_restore']}, 18:20:52 INFO - 'other-e10s': {'talos_options': ['--e10s'], 18:20:52 INFO - 'tests': ['a11yr', 18:20:52 INFO - 'ts_paint', 18:20:52 INFO - 'tpaint', 18:20:52 INFO - 'sessionrestore', 18:20:52 INFO - 'sessionrestore_no_auto_restore']}, 18:20:52 INFO - 'other-e10s_l64': {'talos_options': ['--e10s'], 18:20:52 INFO - 'tests': ['a11yr', 18:20:52 INFO - 'ts_paint', 18:20:52 INFO - 'tpaint', 18:20:52 INFO - 'sessionrestore', 18:20:52 INFO - 'sessionrestore_no_auto_restore']}, 18:20:52 INFO - 'other-e10s_nol64': {'talos_options': ['--e10s'], 18:20:52 INFO - 'tests': ['a11yr', 18:20:52 INFO - 'ts_paint', 18:20:52 INFO - 'tpaint', 18:20:52 INFO - 'sessionrestore', 18:20:52 INFO - 'sessionrestore_no_auto_restore']}, 18:20:52 INFO - 'other_l64': {'tests': ['a11yr', 18:20:52 INFO - 'ts_paint', 18:20:52 INFO - 'tpaint', 18:20:52 INFO - 'sessionrestore', 18:20:52 INFO - 'sessionrestore_no_auto_restore']}, 18:20:52 INFO - 'other_nol64': {'tests': ['a11yr', 18:20:52 INFO - 'ts_paint', 18:20:52 INFO - 'tpaint', 18:20:52 INFO - 'sessionrestore', 18:20:52 INFO - 'sessionrestore_no_auto_restore']}, 18:20:52 INFO - 'svgr': {'tests': ['tsvgx', 18:20:52 INFO - 'tsvgr_opacity', 18:20:52 INFO - 'tart', 18:20:52 INFO - 'tscrollx', 18:20:52 INFO - 'cart']}, 18:20:52 INFO - 'svgr-e10s': {'talos_options': ['--e10s'], 18:20:52 INFO - 'tests': ['tsvgx', 18:20:52 INFO - 'tsvgr_opacity', 18:20:52 INFO - 'tart', 18:20:52 INFO - 'tscrollx', 18:20:52 INFO - 'cart']}, 18:20:52 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 18:20:52 INFO - 'tests': ['tp5o']}, 18:20:52 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 18:20:52 INFO - 'talos_options': ['--e10s'], 18:20:52 INFO - 'tests': ['tp5o']}, 18:20:52 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 18:20:52 INFO - 'talos_options': ['--xperf_path', 18:20:52 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 18:20:52 INFO - 'tests': ['tp5n']}, 18:20:52 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 18:20:52 INFO - 'talos_options': ['--e10s', 18:20:52 INFO - '--xperf_path', 18:20:52 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 18:20:52 INFO - 'tests': ['tp5n']}}, 18:20:52 INFO - 'talos.zip': {'path': '', 18:20:52 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 18:20:52 INFO - Running post-action listener: _resource_record_post_action 18:20:52 INFO - ##### 18:20:52 INFO - ##### Running create-virtualenv step. 18:20:52 INFO - ##### 18:20:52 INFO - Running pre-action listener: _resource_record_pre_action 18:20:52 INFO - Running main action method: create_virtualenv 18:20:52 INFO - Creating virtualenv /builds/slave/test/build/venv 18:20:52 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 18:20:52 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 18:20:52 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 18:20:52 INFO - Using real prefix '/usr' 18:20:52 INFO - New python executable in /builds/slave/test/build/venv/bin/python 18:20:52 INFO - Installing distribute.............................................................................................................................................................................................done. 18:20:54 INFO - Installing pip.................done. 18:20:54 INFO - Return code: 0 18:20:54 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 18:20:54 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://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 18:20:54 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 18:20:54 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 18:20:54 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://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 18:20:54 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 18:20:54 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 18:20:54 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--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 0x7f2c25ee3f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xe208a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xeefdd0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xf823d0>, '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 0xeeded0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xeee360>, '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': 'ed14279e38b05397cf4aa391000001a4-1452821364.736606-2006632967', '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 18:20:54 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--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 18:20:54 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --download-cache /builds/slave/test/build/venv/cache --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 18:20:54 INFO - Using env: {'DISPLAY': ':0', 18:20:54 INFO - 'HOME': '/home/cltbld', 18:20:54 INFO - 'LANG': 'en_US.UTF-8', 18:20:54 INFO - 'LANGUAGE': 'en_US:en', 18:20:54 INFO - 'LOGNAME': 'cltbld', 18:20:54 INFO - 'MAIL': '/var/mail/cltbld', 18:20:54 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 18:20:54 INFO - 'MOZ_NO_REMOTE': '1', 18:20:54 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 18:20:54 INFO - 'NO_EM_RESTART': '1', 18:20:54 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 18:20:54 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 18:20:54 INFO - 'PWD': '/builds/slave/test', 18:20:54 INFO - 'SHELL': '/bin/bash', 18:20:54 INFO - 'SHLVL': '1', 18:20:54 INFO - 'TERM': 'linux', 18:20:54 INFO - 'TMOUT': '86400', 18:20:54 INFO - 'USER': 'cltbld', 18:20:54 INFO - 'XDG_SESSION_COOKIE': 'ed14279e38b05397cf4aa391000001a4-1452821364.736606-2006632967', 18:20:54 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 18:20:54 INFO - '_': '/tools/buildbot/bin/python'} 18:20:55 INFO - Ignoring indexes: https://pypi.python.org/simple/ 18:20:55 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 18:20:55 INFO - Cleaning up... 18:20:55 INFO - Return code: 0 18:20:55 INFO - Installing psutil>=0.7.1 into virtualenv /builds/slave/test/build/venv 18:20: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://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 18:20:55 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 18:20:55 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 18:20: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://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 18:20:55 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 18:20:55 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 18:20:55 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--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>=0.7.1']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f2c25ee3f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xe208a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xeefdd0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xf823d0>, '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 0xeeded0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xeee360>, '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': 'ed14279e38b05397cf4aa391000001a4-1452821364.736606-2006632967', '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 18:20:55 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--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>=0.7.1'] in /builds/slave/test/build 18:20:55 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --download-cache /builds/slave/test/build/venv/cache --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>=0.7.1 18:20:55 INFO - Using env: {'DISPLAY': ':0', 18:20:55 INFO - 'HOME': '/home/cltbld', 18:20:55 INFO - 'LANG': 'en_US.UTF-8', 18:20:55 INFO - 'LANGUAGE': 'en_US:en', 18:20:55 INFO - 'LOGNAME': 'cltbld', 18:20:55 INFO - 'MAIL': '/var/mail/cltbld', 18:20:55 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 18:20:55 INFO - 'MOZ_NO_REMOTE': '1', 18:20:55 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 18:20:55 INFO - 'NO_EM_RESTART': '1', 18:20:55 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 18:20:55 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 18:20:55 INFO - 'PWD': '/builds/slave/test', 18:20:55 INFO - 'SHELL': '/bin/bash', 18:20:55 INFO - 'SHLVL': '1', 18:20:55 INFO - 'TERM': 'linux', 18:20:55 INFO - 'TMOUT': '86400', 18:20:55 INFO - 'USER': 'cltbld', 18:20:55 INFO - 'XDG_SESSION_COOKIE': 'ed14279e38b05397cf4aa391000001a4-1452821364.736606-2006632967', 18:20:55 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 18:20:55 INFO - '_': '/tools/buildbot/bin/python'} 18:20:55 INFO - Ignoring indexes: https://pypi.python.org/simple/ 18:20:55 INFO - Downloading/unpacking psutil>=0.7.1 18:20:55 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 18:20:55 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 18:20:55 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 18:20:55 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 18:20:55 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 18:20:55 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 18:20:57 INFO - Creating supposed download cache at /builds/slave/test/build/venv/cache 18:20:57 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fpsutil-3.1.1.tar.gz 18:20:57 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 18:20:57 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 18:20:57 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 18:20:57 INFO - Installing collected packages: psutil 18:20:57 INFO - Running setup.py install for psutil 18:20:57 INFO - building 'psutil._psutil_linux' extension 18:20:57 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 18:20:57 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 18:20:57 INFO - building 'psutil._psutil_posix' extension 18:20:57 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 18:20:57 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 18:20:57 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 18:20:57 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 18:20:57 INFO - Successfully installed psutil 18:20:57 INFO - Cleaning up... 18:20:57 INFO - Return code: 0 18:20:57 INFO - Installing mozsystemmonitor==0.0.0 into virtualenv /builds/slave/test/build/venv 18:20:57 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://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 18:20:57 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 18:20:57 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 18:20:57 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://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 18:20:57 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 18:20:57 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 18:20:57 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--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.0.0']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f2c25ee3f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xe208a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xeefdd0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xf823d0>, '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 0xeeded0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xeee360>, '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': 'ed14279e38b05397cf4aa391000001a4-1452821364.736606-2006632967', '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 18:20:57 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--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.0.0'] in /builds/slave/test/build 18:20:57 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --download-cache /builds/slave/test/build/venv/cache --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.0.0 18:20:57 INFO - Using env: {'DISPLAY': ':0', 18:20:57 INFO - 'HOME': '/home/cltbld', 18:20:57 INFO - 'LANG': 'en_US.UTF-8', 18:20:57 INFO - 'LANGUAGE': 'en_US:en', 18:20:57 INFO - 'LOGNAME': 'cltbld', 18:20:57 INFO - 'MAIL': '/var/mail/cltbld', 18:20:57 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 18:20:57 INFO - 'MOZ_NO_REMOTE': '1', 18:20:57 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 18:20:57 INFO - 'NO_EM_RESTART': '1', 18:20:57 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 18:20:57 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 18:20:57 INFO - 'PWD': '/builds/slave/test', 18:20:57 INFO - 'SHELL': '/bin/bash', 18:20:57 INFO - 'SHLVL': '1', 18:20:57 INFO - 'TERM': 'linux', 18:20:57 INFO - 'TMOUT': '86400', 18:20:57 INFO - 'USER': 'cltbld', 18:20:57 INFO - 'XDG_SESSION_COOKIE': 'ed14279e38b05397cf4aa391000001a4-1452821364.736606-2006632967', 18:20:57 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 18:20:57 INFO - '_': '/tools/buildbot/bin/python'} 18:20:57 INFO - Ignoring indexes: https://pypi.python.org/simple/ 18:20:57 INFO - Downloading/unpacking mozsystemmonitor==0.0.0 18:20:57 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 18:20:57 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 18:20:57 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 18:20:57 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 18:20:57 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 18:20:57 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 18:20:59 INFO - Downloading mozsystemmonitor-0.0.tar.gz 18:20:59 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fmozsystemmonitor-0.0.tar.gz 18:20:59 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 18:20:59 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=0.7.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.0.0) 18:20:59 INFO - Installing collected packages: mozsystemmonitor 18:20:59 INFO - Running setup.py install for mozsystemmonitor 18:20:59 INFO - Successfully installed mozsystemmonitor 18:20:59 INFO - Cleaning up... 18:20:59 INFO - Return code: 0 18:20:59 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 18:20:59 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://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 18:20:59 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 18:20:59 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 18:20:59 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://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 18:20:59 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 18:20:59 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 18:20:59 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--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 0x7f2c25ee3f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xe208a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xeefdd0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xf823d0>, '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 0xeeded0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xeee360>, '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': 'ed14279e38b05397cf4aa391000001a4-1452821364.736606-2006632967', '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 18:20:59 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--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 18:20:59 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --download-cache /builds/slave/test/build/venv/cache --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 18:20:59 INFO - Using env: {'DISPLAY': ':0', 18:20:59 INFO - 'HOME': '/home/cltbld', 18:20:59 INFO - 'LANG': 'en_US.UTF-8', 18:20:59 INFO - 'LANGUAGE': 'en_US:en', 18:20:59 INFO - 'LOGNAME': 'cltbld', 18:20:59 INFO - 'MAIL': '/var/mail/cltbld', 18:20:59 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 18:20:59 INFO - 'MOZ_NO_REMOTE': '1', 18:20:59 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 18:20:59 INFO - 'NO_EM_RESTART': '1', 18:20:59 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 18:20:59 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 18:20:59 INFO - 'PWD': '/builds/slave/test', 18:20:59 INFO - 'SHELL': '/bin/bash', 18:20:59 INFO - 'SHLVL': '1', 18:20:59 INFO - 'TERM': 'linux', 18:20:59 INFO - 'TMOUT': '86400', 18:20:59 INFO - 'USER': 'cltbld', 18:20:59 INFO - 'XDG_SESSION_COOKIE': 'ed14279e38b05397cf4aa391000001a4-1452821364.736606-2006632967', 18:20:59 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 18:20:59 INFO - '_': '/tools/buildbot/bin/python'} 18:21:00 INFO - Ignoring indexes: https://pypi.python.org/simple/ 18:21:00 INFO - Downloading/unpacking blobuploader==1.2.4 18:21:00 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 18:21:00 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 18:21:00 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 18:21:00 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 18:21:00 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 18:21:00 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 18:21:01 INFO - Downloading blobuploader-1.2.4.tar.gz 18:21:01 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fblobuploader-1.2.4.tar.gz 18:21:01 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 18:21:01 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 18:21:01 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 18:21:01 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 18:21:01 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 18:21:01 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 18:21:01 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 18:21:01 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 18:21:02 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Frequests-1.2.3.tar.gz 18:21:02 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 18:21:02 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 18:21:02 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 18:21:02 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 18:21:02 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 18:21:02 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 18:21:02 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 18:21:02 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 18:21:02 INFO - Downloading docopt-0.6.1.tar.gz 18:21:02 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fdocopt-0.6.1.tar.gz 18:21:02 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 18:21:02 INFO - Installing collected packages: blobuploader, requests, docopt 18:21:02 INFO - Running setup.py install for blobuploader 18:21:02 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 18:21:02 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 18:21:02 INFO - Running setup.py install for requests 18:21:02 INFO - Running setup.py install for docopt 18:21:03 INFO - Successfully installed blobuploader requests docopt 18:21:03 INFO - Cleaning up... 18:21:03 INFO - Return code: 0 18:21:03 INFO - Installing None into virtualenv /builds/slave/test/build/venv 18:21: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://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 18:21:03 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 18:21:03 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 18:21: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://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 18:21:03 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 18:21:03 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 18:21:03 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--no-deps', '--download-cache', '/builds/slave/test/build/venv/cache', '--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 0x7f2c25ee3f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xe208a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xeefdd0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xf823d0>, '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 0xeeded0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xeee360>, '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': 'ed14279e38b05397cf4aa391000001a4-1452821364.736606-2006632967', '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 18:21:03 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--no-deps', '--download-cache', '/builds/slave/test/build/venv/cache', '--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 18:21:03 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --no-deps --download-cache /builds/slave/test/build/venv/cache --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 18:21:03 INFO - Using env: {'DISPLAY': ':0', 18:21:03 INFO - 'HOME': '/home/cltbld', 18:21:03 INFO - 'LANG': 'en_US.UTF-8', 18:21:03 INFO - 'LANGUAGE': 'en_US:en', 18:21:03 INFO - 'LOGNAME': 'cltbld', 18:21:03 INFO - 'MAIL': '/var/mail/cltbld', 18:21:03 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 18:21:03 INFO - 'MOZ_NO_REMOTE': '1', 18:21:03 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 18:21:03 INFO - 'NO_EM_RESTART': '1', 18:21:03 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 18:21:03 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 18:21:03 INFO - 'PWD': '/builds/slave/test', 18:21:03 INFO - 'SHELL': '/bin/bash', 18:21:03 INFO - 'SHLVL': '1', 18:21:03 INFO - 'TERM': 'linux', 18:21:03 INFO - 'TMOUT': '86400', 18:21:03 INFO - 'USER': 'cltbld', 18:21:03 INFO - 'XDG_SESSION_COOKIE': 'ed14279e38b05397cf4aa391000001a4-1452821364.736606-2006632967', 18:21:03 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 18:21:03 INFO - '_': '/tools/buildbot/bin/python'} 18:21:03 INFO - Ignoring indexes: https://pypi.python.org/simple/ 18:21:03 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 18:21:03 INFO - Running setup.py (path:/tmp/pip-cD9Pho-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 18:21:03 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 18:21:03 INFO - Running setup.py (path:/tmp/pip-jn1jgp-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 18:21:03 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 18:21:03 INFO - Running setup.py (path:/tmp/pip-qBtE_3-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 18:21:03 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 18:21:03 INFO - Running setup.py (path:/tmp/pip-zipkFK-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 18:21:03 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 18:21:03 INFO - Running setup.py (path:/tmp/pip-eHA0P9-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 18:21:03 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 18:21:03 INFO - Running setup.py (path:/tmp/pip-DzTHze-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 18:21:03 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 18:21:03 INFO - Running setup.py (path:/tmp/pip-qsW1l6-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 18:21:03 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 18:21:03 INFO - Running setup.py (path:/tmp/pip-Q2IaLk-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 18:21:03 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 18:21:03 INFO - Running setup.py (path:/tmp/pip-nWGgBe-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 18:21:03 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 18:21:03 INFO - Running setup.py (path:/tmp/pip-8_stVH-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 18:21:04 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 18:21:04 INFO - Running setup.py (path:/tmp/pip-wvdGGL-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 18:21:04 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 18:21:04 INFO - Running setup.py (path:/tmp/pip-8RJbww-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 18:21:04 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 18:21:04 INFO - Running setup.py (path:/tmp/pip-eio3AY-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 18:21:04 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 18:21:04 INFO - Running setup.py (path:/tmp/pip-bZbA9B-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 18:21:04 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 18:21:04 INFO - Running setup.py (path:/tmp/pip-oBlAOd-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 18:21:04 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 18:21:04 INFO - Running setup.py (path:/tmp/pip-ICUHzK-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 18:21:04 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 18:21:04 INFO - Running setup.py (path:/tmp/pip-Up16Yu-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 18:21:04 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 18:21:04 INFO - Running setup.py install for manifestparser 18:21:04 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 18:21:04 INFO - Running setup.py install for mozcrash 18:21:04 INFO - Running setup.py install for mozdebug 18:21:04 INFO - Running setup.py install for mozdevice 18:21:04 INFO - Installing sutini script to /builds/slave/test/build/venv/bin 18:21:04 INFO - Installing dm script to /builds/slave/test/build/venv/bin 18:21:04 INFO - Running setup.py install for mozfile 18:21:05 INFO - Running setup.py install for mozhttpd 18:21:05 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 18:21:05 INFO - Running setup.py install for mozinfo 18:21:05 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 18:21:05 INFO - Running setup.py install for mozInstall 18:21:05 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 18:21:05 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 18:21:05 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 18:21:05 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 18:21:05 INFO - Running setup.py install for mozleak 18:21:05 INFO - Running setup.py install for mozlog 18:21:05 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 18:21:05 INFO - Running setup.py install for moznetwork 18:21:05 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 18:21:05 INFO - Running setup.py install for mozprocess 18:21:05 INFO - Running setup.py install for mozprofile 18:21:05 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 18:21:05 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 18:21:05 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 18:21:05 INFO - Running setup.py install for mozrunner 18:21:06 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 18:21:06 INFO - Running setup.py install for mozscreenshot 18:21:06 INFO - Running setup.py install for moztest 18:21:06 INFO - Running setup.py install for mozversion 18:21:06 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 18:21:06 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 18:21:06 INFO - Cleaning up... 18:21:06 INFO - Return code: 0 18:21:06 INFO - Installing None into virtualenv /builds/slave/test/build/venv 18:21: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://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 18:21:06 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 18:21:06 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 18:21: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://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 18:21:06 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 18:21:06 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 18:21:06 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--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 0x7f2c25ee3f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xe208a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xeefdd0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xf823d0>, '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 0xeeded0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xeee360>, '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': 'ed14279e38b05397cf4aa391000001a4-1452821364.736606-2006632967', '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 18:21:06 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--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 18:21:06 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --download-cache /builds/slave/test/build/venv/cache --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 18:21:06 INFO - Using env: {'DISPLAY': ':0', 18:21:06 INFO - 'HOME': '/home/cltbld', 18:21:06 INFO - 'LANG': 'en_US.UTF-8', 18:21:06 INFO - 'LANGUAGE': 'en_US:en', 18:21:06 INFO - 'LOGNAME': 'cltbld', 18:21:06 INFO - 'MAIL': '/var/mail/cltbld', 18:21:06 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 18:21:06 INFO - 'MOZ_NO_REMOTE': '1', 18:21:06 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 18:21:06 INFO - 'NO_EM_RESTART': '1', 18:21:06 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 18:21:06 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 18:21:06 INFO - 'PWD': '/builds/slave/test', 18:21:06 INFO - 'SHELL': '/bin/bash', 18:21:06 INFO - 'SHLVL': '1', 18:21:06 INFO - 'TERM': 'linux', 18:21:06 INFO - 'TMOUT': '86400', 18:21:06 INFO - 'USER': 'cltbld', 18:21:06 INFO - 'XDG_SESSION_COOKIE': 'ed14279e38b05397cf4aa391000001a4-1452821364.736606-2006632967', 18:21:06 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 18:21:06 INFO - '_': '/tools/buildbot/bin/python'} 18:21:06 INFO - Ignoring indexes: https://pypi.python.org/simple/ 18:21:06 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 18:21:06 INFO - Running setup.py (path:/tmp/pip-Z3pqmv-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 18:21:06 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)) 18:21:06 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 18:21:06 INFO - Running setup.py (path:/tmp/pip-akc0QE-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 18:21:06 INFO - Requirement already satisfied (use --upgrade to upgrade): mozcrash==0.16 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)) 18:21:06 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 18:21:06 INFO - Running setup.py (path:/tmp/pip-No5bX2-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 18:21:06 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)) 18:21:06 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 18:21:06 INFO - Running setup.py (path:/tmp/pip-BeD6IP-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 18:21:06 INFO - Requirement already satisfied (use --upgrade to upgrade): mozdevice==0.48 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)) 18:21:06 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 18:21:06 INFO - Running setup.py (path:/tmp/pip-cme9L7-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 18:21:06 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)) 18:21:06 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 18:21:06 INFO - Running setup.py (path:/tmp/pip-ABswtW-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 18:21:06 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)) 18:21:06 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 18:21:06 INFO - Running setup.py (path:/tmp/pip-JFs_2J-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 18:21:07 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)) 18:21:07 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 18:21:07 INFO - Running setup.py (path:/tmp/pip-6yBfl3-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 18:21:07 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)) 18:21:07 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 18:21:07 INFO - Running setup.py (path:/tmp/pip-zYMFap-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 18:21:07 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)) 18:21:07 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 18:21:07 INFO - Running setup.py (path:/tmp/pip-zhQhiI-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 18:21:07 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog==3.1 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)) 18:21:07 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 18:21:07 INFO - Running setup.py (path:/tmp/pip-qKhWIm-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 18:21:07 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)) 18:21:07 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 18:21:07 INFO - Running setup.py (path:/tmp/pip-30hrqO-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 18:21:07 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess==0.22 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)) 18:21:07 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 18:21:07 INFO - Running setup.py (path:/tmp/pip-hmViWH-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 18:21:07 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)) 18:21:07 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 18:21:07 INFO - Running setup.py (path:/tmp/pip-UnNaHS-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 18:21:07 INFO - Requirement already satisfied (use --upgrade to upgrade): mozrunner==6.11 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)) 18:21:07 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 18:21:07 INFO - Running setup.py (path:/tmp/pip-wVlLu3-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 18:21:07 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)) 18:21:07 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 18:21:07 INFO - Running setup.py (path:/tmp/pip-o779yq-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 18:21:07 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)) 18:21:07 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 18:21:07 INFO - Running setup.py (path:/tmp/pip-NC4xxJ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 18:21:07 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)) 18:21:07 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile>=1.0 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozcrash==0.16->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 18:21:07 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog>=3.0 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozcrash==0.16->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 18:21:07 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)) 18:21:07 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.48->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 18:21:07 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.48->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 18:21:07 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.1->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 18:21:07 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 18:21:07 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 18:21:07 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 18:21:07 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 18:21:07 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 18:21:07 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 18:21:09 INFO - Downloading blessings-1.5.1.tar.gz 18:21:09 INFO - Storing download in cache at /builds/slave/test/build/venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fblessings-1.5.1.tar.gz 18:21:09 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 18:21:09 INFO - Installing collected packages: blessings 18:21:09 INFO - Running setup.py install for blessings 18:21:09 INFO - Successfully installed blessings 18:21:09 INFO - Cleaning up... 18:21:09 INFO - Return code: 0 18:21:09 INFO - Done creating virtualenv /builds/slave/test/build/venv. 18:21:09 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 18:21:09 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 18:21:09 INFO - Reading from file tmpfile_stdout 18:21:09 INFO - Current package versions: 18:21:09 INFO - argparse == 1.2.1 18:21:09 INFO - blessings == 1.5.1 18:21:09 INFO - blobuploader == 1.2.4 18:21:09 INFO - docopt == 0.6.1 18:21:09 INFO - manifestparser == 1.1 18:21:09 INFO - mozInstall == 1.12 18:21:09 INFO - mozcrash == 0.16 18:21:09 INFO - mozdebug == 0.1 18:21:09 INFO - mozdevice == 0.48 18:21:09 INFO - mozfile == 1.2 18:21:09 INFO - mozhttpd == 0.7 18:21:09 INFO - mozinfo == 0.9 18:21:09 INFO - mozleak == 0.1 18:21:09 INFO - mozlog == 3.1 18:21:09 INFO - moznetwork == 0.27 18:21:09 INFO - mozprocess == 0.22 18:21:09 INFO - mozprofile == 0.28 18:21:09 INFO - mozrunner == 6.11 18:21:09 INFO - mozscreenshot == 0.1 18:21:09 INFO - mozsystemmonitor == 0.0 18:21:09 INFO - moztest == 0.7 18:21:09 INFO - mozversion == 1.4 18:21:09 INFO - psutil == 3.1.1 18:21:09 INFO - requests == 1.2.3 18:21:09 INFO - wsgiref == 0.1.2 18:21:09 INFO - Installing None into virtualenv /builds/slave/test/build/venv 18:21:09 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://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 18:21:09 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 18:21:09 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 18:21:09 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://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 18:21:09 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 18:21:09 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 18:21:09 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--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 0x7f2c25ee3f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xe208a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xeefdd0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xf823d0>, '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 0xeeded0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xeee360>, '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': 'ed14279e38b05397cf4aa391000001a4-1452821364.736606-2006632967', '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 18:21:09 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--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 18:21:09 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --download-cache /builds/slave/test/build/venv/cache --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 18:21:09 INFO - Using env: {'DISPLAY': ':0', 18:21:09 INFO - 'HOME': '/home/cltbld', 18:21:09 INFO - 'LANG': 'en_US.UTF-8', 18:21:09 INFO - 'LANGUAGE': 'en_US:en', 18:21:09 INFO - 'LOGNAME': 'cltbld', 18:21:09 INFO - 'MAIL': '/var/mail/cltbld', 18:21:09 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 18:21:09 INFO - 'MOZ_NO_REMOTE': '1', 18:21:09 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 18:21:09 INFO - 'NO_EM_RESTART': '1', 18:21:09 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 18:21:09 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 18:21:09 INFO - 'PWD': '/builds/slave/test', 18:21:09 INFO - 'SHELL': '/bin/bash', 18:21:09 INFO - 'SHLVL': '1', 18:21:09 INFO - 'TERM': 'linux', 18:21:09 INFO - 'TMOUT': '86400', 18:21:09 INFO - 'USER': 'cltbld', 18:21:09 INFO - 'XDG_SESSION_COOKIE': 'ed14279e38b05397cf4aa391000001a4-1452821364.736606-2006632967', 18:21:09 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 18:21:09 INFO - '_': '/tools/buildbot/bin/python'} 18:21:10 INFO - Ignoring indexes: https://pypi.python.org/simple/ 18:21:10 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)) 18:21:10 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)) 18:21:10 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)) 18:21:10 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)) 18:21:10 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)) 18:21:10 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)) 18:21:10 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)) 18:21:10 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)) 18:21:10 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)) 18:21:10 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)) 18:21:10 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)) 18:21:10 INFO - Cleaning up... 18:21:10 INFO - Return code: 0 18:21:10 INFO - Installing jsonschema into virtualenv /builds/slave/test/build/venv 18:21:10 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://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 18:21:10 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 18:21:10 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 18:21:10 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://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 18:21:10 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 18:21:10 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 18:21:10 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--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 0x7f2c25ee3f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xe208a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xeefdd0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xf823d0>, '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 0xeeded0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xeee360>, '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': 'ed14279e38b05397cf4aa391000001a4-1452821364.736606-2006632967', '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 18:21:10 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--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 18:21:10 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --download-cache /builds/slave/test/build/venv/cache --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 18:21:10 INFO - Using env: {'DISPLAY': ':0', 18:21:10 INFO - 'HOME': '/home/cltbld', 18:21:10 INFO - 'LANG': 'en_US.UTF-8', 18:21:10 INFO - 'LANGUAGE': 'en_US:en', 18:21:10 INFO - 'LOGNAME': 'cltbld', 18:21:10 INFO - 'MAIL': '/var/mail/cltbld', 18:21:10 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 18:21:10 INFO - 'MOZ_NO_REMOTE': '1', 18:21:10 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 18:21:10 INFO - 'NO_EM_RESTART': '1', 18:21:10 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 18:21:10 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 18:21:10 INFO - 'PWD': '/builds/slave/test', 18:21:10 INFO - 'SHELL': '/bin/bash', 18:21:10 INFO - 'SHLVL': '1', 18:21:10 INFO - 'TERM': 'linux', 18:21:10 INFO - 'TMOUT': '86400', 18:21:10 INFO - 'USER': 'cltbld', 18:21:10 INFO - 'XDG_SESSION_COOKIE': 'ed14279e38b05397cf4aa391000001a4-1452821364.736606-2006632967', 18:21:10 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 18:21:10 INFO - '_': '/tools/buildbot/bin/python'} 18:21:10 INFO - Ignoring indexes: https://pypi.python.org/simple/ 18:21:10 INFO - Downloading/unpacking jsonschema 18:21: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 18:21: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 18:21: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 18:21: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 18:21: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 18:21: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 18:21:12 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 18:21:12 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fjsonschema-2.5.1-py2.py3-none-any.whl 18:21:12 INFO - Downloading/unpacking functools32 (from jsonschema) 18:21:12 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 18:21:12 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 18:21:12 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 18:21:12 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 18:21:12 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 18:21:12 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 18:21:12 INFO - Downloading functools32-3.2.3-2.tar.gz 18:21:12 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Ffunctools32-3.2.3-2.tar.gz 18:21:12 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/functools32/setup.py) egg_info for package functools32 18:21:12 INFO - warning: no files found matching '*.txt' 18:21:12 INFO - no previously-included directories found matching 'build' 18:21:12 INFO - no previously-included directories found matching 'dist' 18:21:12 INFO - no previously-included directories found matching '.git*' 18:21:12 INFO - Installing collected packages: jsonschema, functools32 18:21:12 INFO - Running setup.py install for functools32 18:21:12 INFO - warning: no files found matching '*.txt' 18:21:12 INFO - no previously-included directories found matching 'build' 18:21:12 INFO - no previously-included directories found matching 'dist' 18:21:12 INFO - no previously-included directories found matching '.git*' 18:21:12 INFO - Successfully installed jsonschema functools32 18:21:12 INFO - Cleaning up... 18:21:12 INFO - Return code: 0 18:21:12 INFO - Installing flake8 into virtualenv /builds/slave/test/build/venv 18:21:12 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://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 18:21:12 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 18:21:12 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 18:21:12 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://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 18:21:12 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 18:21:12 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 18:21:12 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--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', 'flake8']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f2c25ee3f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xe208a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xeefdd0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xf823d0>, '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 0xeeded0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xeee360>, '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': 'ed14279e38b05397cf4aa391000001a4-1452821364.736606-2006632967', '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 18:21:12 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--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', 'flake8'] in /builds/slave/test/build 18:21:12 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --download-cache /builds/slave/test/build/venv/cache --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 flake8 18:21:12 INFO - Using env: {'DISPLAY': ':0', 18:21:12 INFO - 'HOME': '/home/cltbld', 18:21:12 INFO - 'LANG': 'en_US.UTF-8', 18:21:12 INFO - 'LANGUAGE': 'en_US:en', 18:21:12 INFO - 'LOGNAME': 'cltbld', 18:21:12 INFO - 'MAIL': '/var/mail/cltbld', 18:21:12 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 18:21:12 INFO - 'MOZ_NO_REMOTE': '1', 18:21:12 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 18:21:12 INFO - 'NO_EM_RESTART': '1', 18:21:12 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 18:21:12 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 18:21:12 INFO - 'PWD': '/builds/slave/test', 18:21:12 INFO - 'SHELL': '/bin/bash', 18:21:12 INFO - 'SHLVL': '1', 18:21:12 INFO - 'TERM': 'linux', 18:21:12 INFO - 'TMOUT': '86400', 18:21:12 INFO - 'USER': 'cltbld', 18:21:12 INFO - 'XDG_SESSION_COOKIE': 'ed14279e38b05397cf4aa391000001a4-1452821364.736606-2006632967', 18:21:12 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 18:21:12 INFO - '_': '/tools/buildbot/bin/python'} 18:21:12 INFO - Ignoring indexes: https://pypi.python.org/simple/ 18:21:12 INFO - Downloading/unpacking flake8 18:21:12 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 18:21:12 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 18:21:12 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 18:21:12 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 18:21:12 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 18:21:12 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 18:21:14 INFO - Downloading flake8-2.5.0-py2.py3-none-any.whl 18:21:14 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fflake8-2.5.0-py2.py3-none-any.whl 18:21:14 INFO - Downloading/unpacking mccabe>=0.2.1,<0.4 (from flake8) 18:21: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 18:21: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 18:21: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 18:21: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 18:21: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 18:21: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 18:21:14 INFO - Downloading mccabe-0.3.1-py2.py3-none-any.whl 18:21:14 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fmccabe-0.3.1-py2.py3-none-any.whl 18:21:14 INFO - Downloading/unpacking pyflakes>=0.8.1,<1.1 (from flake8) 18:21: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 18:21: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 18:21: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 18:21: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 18:21: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 18:21: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 18:21:14 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fpyflakes-1.0.0-py2.py3-none-any.whl 18:21:14 INFO - Downloading/unpacking pep8>=1.5.7,!=1.6.0,!=1.6.1,!=1.6.2 (from flake8) 18:21: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 18:21: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 18:21: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 18:21: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 18:21: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 18:21: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 18:21:15 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fpep8-1.5.7.tar.gz 18:21:15 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/pep8/setup.py) egg_info for package pep8 18:21:15 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 18:21:15 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 18:21:15 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 18:21:15 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 18:21:15 INFO - no previously-included directories found matching 'docs/_build' 18:21:15 INFO - Installing collected packages: flake8, mccabe, pyflakes, pep8 18:21:15 INFO - Running setup.py install for pep8 18:21:15 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 18:21:15 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 18:21:15 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 18:21:15 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 18:21:15 INFO - no previously-included directories found matching 'docs/_build' 18:21:15 INFO - Installing pep8 script to /builds/slave/test/build/venv/bin 18:21:15 INFO - Successfully installed flake8 mccabe pyflakes pep8 18:21:15 INFO - Cleaning up... 18:21:15 INFO - Return code: 0 18:21:15 INFO - Running post-action listener: _resource_record_post_action 18:21:15 INFO - Running post-action listener: _start_resource_monitoring 18:21:15 INFO - Starting resource monitoring. 18:21:15 INFO - ##### 18:21:15 INFO - ##### Running install step. 18:21:15 INFO - ##### 18:21:15 INFO - Running pre-action listener: _resource_record_pre_action 18:21:15 INFO - Running main action method: install 18:21:15 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 18:21:15 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 18:21:15 INFO - Reading from file tmpfile_stdout 18:21:15 INFO - Detecting whether we're running mozinstall >=1.0... 18:21:15 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 18:21:15 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 18:21:15 INFO - Reading from file tmpfile_stdout 18:21:15 INFO - Output received: 18:21:15 INFO - Usage: mozinstall [options] installer 18:21:15 INFO - Options: 18:21:15 INFO - -h, --help show this help message and exit 18:21:15 INFO - -d DEST, --destination=DEST 18:21:15 INFO - Directory to install application into. [default: 18:21:15 INFO - "/builds/slave/test"] 18:21:15 INFO - --app=APP Application being installed. [default: firefox] 18:21:15 INFO - mkdir: /builds/slave/test/build/application 18:21:15 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '/builds/slave/test/build/firefox-46.0a1.en-US.linux-x86_64.tar.bz2', '--destination', '/builds/slave/test/build/application'] 18:21:15 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall /builds/slave/test/build/firefox-46.0a1.en-US.linux-x86_64.tar.bz2 --destination /builds/slave/test/build/application 18:21:31 INFO - Reading from file tmpfile_stdout 18:21:31 INFO - Output received: 18:21:31 INFO - /builds/slave/test/build/application/firefox/firefox 18:21:31 INFO - Running post-action listener: _resource_record_post_action 18:21:31 INFO - ##### 18:21:31 INFO - ##### Running run-tests step. 18:21:31 INFO - ##### 18:21:31 INFO - Running pre-action listener: _resource_record_pre_action 18:21:31 INFO - Running main action method: run_tests 18:21:31 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 18:21:31 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 18:21:31 INFO - Python 2.7.3 18:21:31 INFO - Return code: 0 18:21:31 INFO - grabbing minidump binary from tooltool 18:21:31 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://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 18:21:31 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: {'error_list': [{'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xf823d0>, '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 0xeeded0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xeee360>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 18:21:31 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 18:21:31 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 18:21:31 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 18:21:31 INFO - Return code: 0 18:21:31 INFO - Chmoding /builds/slave/test/build/linux64-minidump_stackwalk to 0755 18:21:31 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 18:21:31 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 18:21:31 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/linux64-minidump_stackwalk 18:21:31 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 18:21:31 INFO - Running command: ['/builds/slave/test/build/venv/bin/flake8', '/builds/slave/test/build/tests/talos/talos'] 18:21:31 INFO - Copy/paste: /builds/slave/test/build/venv/bin/flake8 /builds/slave/test/build/tests/talos/talos 18:21:32 INFO - Return code: 0 18:21:32 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Firefox-Non-PGO', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/EIKdsMZ6RPmyPTx6I7Y_yA/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-035', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log'] in /builds/slave/test/build 18:21:32 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/tests/talos/talos/run_tests.py --branchName Firefox-Non-PGO --suite dromaeojs-e10s --executablePath /builds/slave/test/build/application/firefox/firefox --symbolsPath https://queue.taskcluster.net/v1/task/EIKdsMZ6RPmyPTx6I7Y_yA/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.crashreporter-symbols.zip --title talos-linux64-ix-035 --webServer localhost --log-tbpl-level=debug --log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log --log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log 18:21:32 INFO - Using env: {'DISPLAY': ':0', 18:21:32 INFO - 'HOME': '/home/cltbld', 18:21:32 INFO - 'LANG': 'en_US.UTF-8', 18:21:32 INFO - 'LANGUAGE': 'en_US:en', 18:21:32 INFO - 'LOGNAME': 'cltbld', 18:21:32 INFO - 'MAIL': '/var/mail/cltbld', 18:21:32 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 18:21:32 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/linux64-minidump_stackwalk', 18:21:32 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 18:21:32 INFO - 'MOZ_NO_REMOTE': '1', 18:21:32 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 18:21:32 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 18:21:32 INFO - 'NO_EM_RESTART': '1', 18:21:32 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 18:21:32 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 18:21:32 INFO - 'PWD': '/builds/slave/test', 18:21:32 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 18:21:32 INFO - 'SHELL': '/bin/bash', 18:21:32 INFO - 'SHLVL': '1', 18:21:32 INFO - 'TERM': 'linux', 18:21:32 INFO - 'TMOUT': '86400', 18:21:32 INFO - 'USER': 'cltbld', 18:21:32 INFO - 'XDG_SESSION_COOKIE': 'ed14279e38b05397cf4aa391000001a4-1452821364.736606-2006632967', 18:21:32 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 18:21:32 INFO - '_': '/tools/buildbot/bin/python'} 18:21:32 INFO - Calling ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Firefox-Non-PGO', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/EIKdsMZ6RPmyPTx6I7Y_yA/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-035', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log'] with output_timeout 3600 18:21:32 INFO - mozversion application_buildid: 20160114165541 18:21:32 INFO - mozversion application_changeset: 9a358be6fa798f24deecac1b502742b2c37cd6bd 18:21:32 INFO - mozversion application_display_name: Nightly 18:21:32 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 18:21:32 INFO - mozversion application_name: Firefox 18:21:32 INFO - mozversion application_remotingname: firefox 18:21:32 INFO - mozversion application_repository: https://hg.mozilla.org/mozilla-central 18:21:32 INFO - mozversion application_vendor: Mozilla 18:21:32 INFO - mozversion application_version: 46.0a1 18:21:32 INFO - mozversion platform_buildid: 20160114165541 18:21:32 INFO - mozversion platform_changeset: 9a358be6fa798f24deecac1b502742b2c37cd6bd 18:21:32 INFO - mozversion platform_repository: https://hg.mozilla.org/mozilla-central 18:21:32 INFO - mozversion platform_version: 46.0a1 18:21:32 INFO - using testdate: 1452824492 18:21:32 INFO - actual date: 1452824492 18:21:32 INFO - starting webserver on 'localhost:47470' 18:21:32 INFO - SUITE-START | Running 3 tests 18:21:32 INFO - TEST-START | dromaeo_css 18:21:32 INFO - operating with platform_type : linux_ 18:21:32 INFO - Initialising browser for dromaeo_css test... 18:21:32 INFO - TEST-INFO | started process 12749 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmp3B0GM5/profile http://localhost:47470/getInfo.html) 18:21:36 INFO - PROCESS | 12749 | 18:21:36 INFO - PROCESS | 12749 | (process:12831): GLib-CRITICAL **: g_path_get_basename: assertion `file_name != NULL' failed 18:21:37 INFO - PROCESS | 12749 | __metrics Screen width/height:1600/1200 18:21:37 INFO - PROCESS | 12749 | colorDepth:24 18:21:37 INFO - PROCESS | 12749 | Browser inner width/height: 1024/697 18:21:37 INFO - PROCESS | 12749 | __metrics 18:21:37 INFO - PROCESS | 12749 | JavaScript error: resource://gre/modules/PerformanceStats.jsm, line 211: NS_ERROR_NOT_AVAILABLE: Component returned failure code: 0x80040111 (NS_ERROR_NOT_AVAILABLE) [nsIPerformanceStatsService.isMonitoringJank] 18:21:38 INFO - TEST-INFO | 12749: exit 0 18:21:38 INFO - Browser initialized. 18:21:38 INFO - Running cycle 1/1 for dromaeo_css test... 18:21:38 INFO - TEST-INFO | started process 12880 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmp3B0GM5/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 18:21:39 INFO - PROCESS | 12880 | 18:21:39 INFO - PROCESS | 12880 | (process:12936): GLib-CRITICAL **: g_path_get_basename: assertion `file_name != NULL' failed 18:21:50 INFO - PROCESS | 12880 | RSS: Main: 150712320 18:21:50 INFO - PROCESS | 12880 | 18:22:39 INFO - PROCESS | 12880 | 1452824559977 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] 18:24:51 INFO - PROCESS | 12880 | Cycle 1(1): loaded http://localhost:47470/tests/dromaeo/cssquery-dojo.html (next: http://localhost:47470/tests/dromaeo/cssquery-ext.html) 18:24:52 INFO - PROCESS | 12880 | RSS: Main: 154771456 18:24:52 INFO - PROCESS | 12880 | 18:27:54 INFO - PROCESS | 12880 | Cycle 1(1): loaded http://localhost:47470/tests/dromaeo/cssquery-ext.html (next: http://localhost:47470/tests/dromaeo/cssquery-jquery.html) 18:27:54 INFO - PROCESS | 12880 | RSS: Main: 151863296 18:27:54 INFO - PROCESS | 12880 | 18:30:56 INFO - PROCESS | 12880 | Cycle 1(1): loaded http://localhost:47470/tests/dromaeo/cssquery-jquery.html (next: http://localhost:47470/tests/dromaeo/cssquery-mootools.html) 18:30:57 INFO - PROCESS | 12880 | RSS: Main: 152793088 18:30:57 INFO - PROCESS | 12880 | 18:33:59 INFO - PROCESS | 12880 | Cycle 1(1): loaded http://localhost:47470/tests/dromaeo/cssquery-mootools.html (next: http://localhost:47470/tests/dromaeo/cssquery-prototype.html) 18:33:59 INFO - PROCESS | 12880 | RSS: Main: 151171072 18:33:59 INFO - PROCESS | 12880 | 18:37:02 INFO - PROCESS | 12880 | Cycle 1(1): loaded http://localhost:47470/tests/dromaeo/cssquery-prototype.html (next: http://localhost:47470/tests/dromaeo/cssquery-yui.html) 18:37:03 INFO - PROCESS | 12880 | RSS: Main: 150712320 18:37:03 INFO - PROCESS | 12880 | 18:40:05 INFO - PROCESS | 12880 | Cycle 1(1): loaded http://localhost:47470/tests/dromaeo/cssquery-yui.html (next: http://localhost:47470/tests/dromaeo/cssquery-dojo.html) 18:40:05 INFO - PROCESS | 12880 | RSS: Main: 152977408 18:40:05 INFO - PROCESS | 12880 | 18:40:05 INFO - PROCESS | 12880 | __start_tp_report 18:40:05 INFO - PROCESS | 12880 | _x_x_mozilla_page_load 18:40:05 INFO - PROCESS | 12880 | _x_x_mozilla_page_load_details 18:40:05 INFO - PROCESS | 12880 | |i|pagename|runs| 18:40:05 INFO - PROCESS | 12880 | |0;dojo.html;2590.080521414899;2621.3708709909615;2623.790096792257;2625.2386807825733;2634.380920483686;4416.911661766762;4454.287314029756;4464.39730636364;4528.071745292215;4564.794584243708;4480.910381792362;4506.662000349978;4554.521775213605;4589.908201835961;4602.309653551969;4217.304144816102;4283.400323954649;4333.328334108218;4343.739375637456;4365.890852728676;4231.280682284004;4241.618254357108;4249.426327445802;4318.762468064255;4325.307950727884;4113.177364527107;4196.034911970233;4270.743755374688;4286.76422796746;4296.763677997709;4191.392248124005;4225.661947044229;4232.597903199191;4236.406903033578;4244.108737165199;4143.150654115899;4158.91682166355;4170.72890262132;4180.080382315886;4193.811278492475;4385.232584297735;4425.889352766175;4434.933475997863;4457.799399027052;4493.595576398107;4823.927641085386;4829.275608658694;4839.491853355417;4859.82990595331;4888.41339039314;4835.782389792468;4871.952530205987;4872.3422337984275;4882.755862206911;4917.950820491785;4405.713628614129;4443.533428989974;4480.708753930984;4521.095780843844;4527.7736113194205;4983.451820299837;4984.950150498521;5005.099082165172;5009.12340340439;5056.84829455117;4757.381540399726;4772.618190544748;4788.904221915543;4829.348038014823;4863.80544778212;4732.52674732524;4776.880577985508;4818.807247710052;4820.060088282751;4876.731779752076;4774;4789.473157952622;4820.662553621213;4825.179719447702;4875.439324477659;4582.518835522289;4753.4295884493395;4782.33047373368;4783.808647654125;4807.471178170398;3986.963389518746;3998.2203470323007;4026.7181297309494;4063.2686116499312;4065.0040740018294;3520.4015317396106;3542.362374772514;3548.964510354915;3559.857605695795;3579.1231148368297;4111.403846442249;4170.979145104255;4192.371144328315;4200.978995105005;4247.87256382309;4829.492903245108;4884.120858245479;4926.679765815282;4931.9753401232765;4973.2540118981715;4210.59999300066;4221.050263690645;4225.619694227473;4277.379779931893;4288.785560721952;4217.40956266123;4281.357796330575;4302.204092242945;4310.849120280838;4357.847475338348;4549.3176023596725;4566.4048740071885;4588.426446694163;4597.379353787196;4642.976785116053;4867.123917694849;4884.951150488591;4895.069936712013;4910.8281210157475;4919.508049195195;4437.201303765353;4508.819647214074;4595.632349412106;4610.608098311681;4613.054323863533;4763.095011947719;4792.209285467999;4793.952060479351;4798.568128868418;4818.734969576707;4838.927416088691;4845.709257444564;4867.050925069578;4890.853274401774;4941.357623508921;4551.590356867898;4617.12274667812;4656.41794775653;4704.247320428715;4744.7390393528685;4724.456687480846;4737.24204127338;4748.715077095248;4749.2876068589985;4798.448178459522;4634.559716826896;4638.582527572535;4649.116667833101;4662.067586482649;4688.413948256468;4583.106294272585;4668.206404911105;4677;4757.16749568831;4806.375171227718;4603.631709463168;4637.86086417408;4646.535346465326;4646.93029604563;4707.835225767081 18:40:05 INFO - PROCESS | 12880 | |1;ext.html;494.36474130741993;498.27003439960475;509.68144909431606;537.7418838957303;548.4241546376305;32409.351812963756;33276.16809579762;33363.833180834095;33482.33035339292;33516.83241583795;35174;35463.2907341853;35741;35758.64241357586;35809;7542.472026958115;7705.537667739954;7716.112647045577;7744.38044956405;7748.6125693715085;7539;7677.961610191969;7695.961520192419;7698.692052317901;7715.382769378436;7830.412719046066;7887.8422431551335;7914.683412663487;7916.841663166733;7925.9603701981405;7781.727639532617;7841.764747057598;7871.527708337518;7888.8561158631965;7897.723579674684;7650.42621803367;7770.728024519171;7801.765947021599;7816.804579885492;7820.608969551499;35434;36042.81978590116;36051.45922811134;36093;36184.81907590445;3144.009636964349;3211.775175737699;3430.8970730878113;3436.202995689752;3739.775613463201;27183;27538.724612753816;27578.66263574532;27839.02563410271;28004;3324.401607710611;3387.119348969261;3388.9661103389144;3406.131436483681;3500.667436593545;161359;162069;162282;162776;163369;37948.81025594854;38782.612173878464;52223.73888130611;53809.730951344995;53825.1926221107;36010.639893601256;36024.279514409565;36081.63918360835;36117;36182.638173617925;13369.799453008212;13549.187048777105;13701.588952331445;13710.45158193681;13764.518241861486;10932.508037138348;11085.113190944705;11099.556017759362;11118.610848620421;11121.55513779456;13072.150310229805;13267.535636252685;13276.468941242436;13324.133931294435;13396.062275640612;5466.180072989084;5512.6968016758665;5522.502974732293;5559.749811258503;5595.21666966625;882.1046637662778;889.5818965086528;913.963441462334;945.2532499325594;959.0888655777039;20988.160473581192;21025.15899364008;21097.78902210989;21344.679829802564;21684.457888552595;945.1493655709916;972.6741541583507;1034.8292531732332;1041.5885725138528;1102.9687242428195;12496.75006499883;12611.558595449114;12702.87297127017;12780.552680656132;12896.161749486253;303125;310553;311082;311817;312219;47824;48176.27735583969;48180;48199;48253.75873120612;1181.8640856301463;1234.7900856854355;1238.68413554543;1251.355551890777;1271.9427625756864;24781.25656230316;24997.12510062139;25124;25241.11656092028;25298.74701252964;41971.79014105032;42700;42732.78633606812;42903.35644965265;42907.570924290354;235974;237009;237720;239460;240220;38780;39402.60597393989;40167.1966560673;40570.59429405786;41138.58861411468;38364.232715346094;38494.80752596219;38752.6124738749;39123.80438097791;39620.603793961694;32230;32302.35395292128;32699.182520437178;33133.66866331306;35959.28081438409;32669.836650816593;33431.83284083564;33457.163570910925;35607.64392356147;36065.27869442649;35746;35791.64208357883;35882;39026;39781.80109099552;30909;32272;32825.83587082145;32991.50512742263;33184.50223246701;24916.87541562353;25917.22248332553;26596;27204.31989200286;27620.723792761815 18:40:05 INFO - PROCESS | 12880 | |2;jquery.html;346.1881886975044;348.78375407247506;352.36750033689543;355.42066431716296;356.4172577835242;13929.791053134199;14369.2815359232;14668.559943201695;15386.769198462003;16054.678906421865;10296.691099267015;10607.469626518681;12663.30351830649;15033;15096.849031509682;4563.863084107482;4604.631629469651;4701.7414042227665;5002.274670172841;5037.017781532602;4947.060058588874;5034.974825125888;5037;5039.420466646327;5044.041632089909;4854.441739200002;4943.9752801235945;5014.2979982802435;5143.922841157367;5144.588432925357;5052.393712754475;5066.645334826564;5111.974440127813;5188.9740551297;5708.686022268774;5050.141475949097;5071.949280507221;5098.898022039575;5103.081445339837;5108.080545501808;16180.35278588855;17223.827761722347;18033.639327213383;18035.188416521287;18116.547086322815;1840.6042700819255;1880.3512788088087;1904.7428597139346;1942.4269840396976;1959.6962470817045;8983.371164018521;10306.948465257701;11452.854714528563;12073.27560346382;12449.94175495084;1739.060907110159;1749.212854215608;1777.9111044447725;1795.9820401795946;1813.6010077782867;42636.57363426357;42999;43670.56329436697;43699.56300437018;43999.78000109979;9393.671221507215;9738.75653108678;9826.312158149003;9837.55730992107;9911.058449447435;12412.503499860086;12440.688982775322;12446.502139914483;12465.93767031159;12499.250044997329;6900.723971041202;6992.405645520188;7169.318914703095;7281.417486601059;7316.231795661379;6877.58734475923;6916.446684265246;6929.237783843773;6934.341237582422;6938.5836849789175;4186.748795072305;4253.21315556623;4262.744235345889;4272.230998420314;4307.913841723148;1652.2151977810684;1709.4102534625783;1740.2255996081622;1779.3060706324543;1796.1109250920879;854.5171977832629;860.5095095795461;923.5613083785282;927.2165020557618;934.0985948559537;14308.427662893368;14741.778873316909;14859.851401485847;15344.386224551115;15407;860.9139086091341;877.2455688108349;879.090141703334;897.1970086772433;951.0679534056525;8428.367872409593;8836.8674469883;8843.60203790831;9074.183323500785;9240.8613870792;132688;132745.336273318;132963.3351833254;133162.33418832844;133764;58881.70559147262;60688.69655651782;61857.072143917874;62653.373466265664;63863;1093.5953697131954;1106.3804269609045;1110.972225694348;1120.3669926491507;1124.516457923101;13623.318834058457;13851.515196968057;13913.791293130813;13958.860411395755;13971.301434928417;29394.265143371587;29396.55905161467;29510.40979180447;29557.85221073881;30212.395752084394;38323.61676383312;38602.6139738599;38784.41823372708;39468.40797388099;39501.604983949794;2450.9387265317796;6449.677516124269;6476.6114033158165;6694.230163531256;6899.374962557605;7885.487443316396;9472.857907131262;9838.36050656705;9893.307468477426;10022.3485473444;8036.919630803851;8574.78563035929;8615.483071015758;8685.652573896974;8781.780455488664;8528.573571321285;8662;8882.689105881263;8914.484537628488;9094.363394562317;8796.868046979429;8835.823283534422;8854.867176992222;8904.154105359981;8926.776830579287;6326.8734625306315;6474.643894585843;6533.869322613426;6606.471482281502;6848.657567121524;7568.924310757042;8506.574671266535;8738.169873861973;8756.080611535697;8767.123287671182 18:40:05 INFO - PROCESS | 12880 | |3;mootools.html;1373.6771858613226;1383.2806940390997;1496.7305884940706;1679.6976544222034;1707.2488105233697;5820.592558520894;5953.553483488745;6539;6732.730690772375;6755.493337999651;6462.612243265407;6603.768868089618;6658.966705166467;6659.667016649172;6676.833079173023;2068.6276470235316;2086.1655337864822;2091.393495886191;2092.204962114394;2101.0965284927474;2001.1495114576246;2004.0881398963436;2026.0882602828785;2052.3945436096387;2063.030375723415;2010.6883433067899;2015.5162760937342;2017.072146812468;2029.5332073623076;2036.6435873722114;2037.2156719662962;2050.507878109258;2050.6411378008866;2058.433930669078;2064.876107433559;2004.2484068474323;2008.0461780654218;2030.9289174878957;2037.9694304585444;2042.3158241988951;6723.226828914689;6780.72877084916;6784.118064651564;6797.626130562817;6822.590644561342;4022.235775202702;4143.7720925349095;4150.8547200848125;4161.126163505667;4162;2585.482903419305;2597.6623039005;2624.6063090536572;2689.6772387313454;2714.348556346463;812.2608426332009;823.3289868756943;825.7729124490753;840.7892634606147;866.9263112635433;9081.818363632756;9083.22792562633;9123.133302336268;9141.497217653026;9143.77140571491;3677.963220367762;3683.4658974448553;3722.218334149805;3728.12389088564;3764.6800021997888;7906.52560846351;7931.801704957422;7932.920670793334;7935.56354400502;7940.245676660708;4096.56986016464;4099.508059032875;4107.712460127822;4120.464339635828;4141.565135660772;3273.116258610162;3320.0869760815967;3597.1546686528645;3742.607026262258;3743.3636281832155;3180.8727650894166;3210.1493104327374;3222.4199644064292;3242.886498972525;3254.6094468663914;1011.1506334678905;1030.9484525773682;1036.160709825044;1046.9685909422728;1049.6536143072767;1163.3601519164426;1173.1494666366987;1179.31010358941;1197.6586672798385;1197.8921897029309;6263.906041409383;6285.088662143963;6302.1177035215105;6316.905246421307;6326.240851097806;1008.8184126857236;1021.7905329407454;1022.867027286448;1030.2015937648382;1055.8205105132147;4943.060818444484;5051.570616497565;5062.898742025139;5069.923951140662;5091.1854103343285;7756.883646745303;7808.41436892224;7863.370930325675;7994.2805147537;8003.559804210708;7708.807279818049;7717;7743.845123097506;7744.883826742604;7876.960615196887;6166.845828854314;6222.377762223832;6255.6872156392;6256.249250090018;6282.340354262737;5914.526837853047;5928.9110663339225;5991.67045812467;5999.5800293979;6001.669908155093;6874.312568743286;6977.581345119106;6991.44068474531;7024.438044956289;7038.014677945194;7160.069191005136;7165.749198778018;7173.784786456415;7192.568445893263;7259.637018148966;5293.444188360167;5455.372632147354;5983.820485385445;6017.428344307284;6047.879042419215;6192.876142477216;6327.303996560283;6344.682765861596;6345.619262844244;6351.745930162741;5776.537876969748;5980.8803823924145;6027.57806953509;6045.78839740607;6160;5957.76168953237;6033.607815491979;6108.847278818065;6122.663253520921;6130.417610327012;5996.220491336273;6130.264368275835;6205.782797602063;6231.1276421300145;6232.781852635136;5515.779368825202;5647.407022262768;5656.038473459439;5660.490555849993;5671.177679236405;5603.7758489659955;5669.858253543694;5716.456936591017;5719.0277652798295;5726.969145553674 18:40:05 INFO - PROCESS | 12880 | |4;prototype.html;303.91642298367947;315.6590881847603;319.51752853191675;320.1053056706505;320.9566708494353;5387.838364849061;5473;5529.834104976847;5570.721463926808;5600.803971860985;5367.919481207785;5486;5490.011797876381;5493.917591236134;5494.697791621459;4237.152569486099;4262.019735460846;4274.871753847374;4281.100968796541;4284.528701842794;4296.699231053827;4297.871063868089;4300.97849510752;4301.419308393374;4307.719998200123;4074.9388759168637;4195.370694395834;4244.957550424502;4252.936205956913;4260.275753121961;4201.43280657112;4217.6204141627095;4220.78896055199;4221.430106935571;4233.23801715691;3685.760425572329;3688;3689.2068205335713;3692.2615476904457;3697.7226707997006;5199.662021968597;5290.021346050993;5304.522592966651;5308.787648494055;5338.893222135574;4808.951910480921;4827.155247831615;4832.951670483285;4834;4836.177849765549;5799.246098007275;5800.331847350224;5801.24583804107;5804.9419505805245;5812.186293918855;3871.903202419962;3950.822213000422;3955.663768579674;3957.881263562098;3958.485396898385;6020.789272375446;6076.453119219292;6081.969590152065;6095.786647467362;6099.5425343099005;4093.8976525586504;4126.174765047002;4126.773027483518;4136.358864376027;4144.647704945113;4173.52004519478;4189.120284740177;4191.140816132685;4207.705460617789;4209.5579964103945;4742.112971539386;4835.0571638530855;4837.782299796518;4841.515848415201;4847.418309802846;5735.8566035849435;5780.71096445176;5792.768289268382;5798.797042103591;5810;1456.3373664982619;1481.4370539195038;1486.8736157426524;1490.1059364381501;1492.1420183394591;983.341161421849;986.6300137448457;991.3754334769194;999.9350042247231;1010.7321559786662;5073.695578265242;5100.948990510122;5111.795528178905;5117.769700363493;5121.411037730634;5960.552958528127;6002.549808764273;6009.699515024231;6027.8794424111275;6033.215681961405;5060.797568097235;5113.207452844815;5114.64197506171;5116.360454943132;5122.564582010496;3164.47786115293;3236;3255.348930213919;3256.0394683568406;3277.6066871975518;5634.32388113429;5635.802746903839;5636.126400407943;5639.154126881001;5640.351359593617;6082.635041897501;6253.5622506425025;6254.718537665725;6286.088517164985;6289.685515724195;5635.21107045014;5672;5685.204071430003;5700.543956483554;5702.030654788696;6075.605085669417;6087.9391206087375;6088.634681919099;6089.269287685506;6098.390160983866;5789.189513468202;5921.881562368642;5946.524278057832;5958.19564358806;5969.04495280753;5634.943650563606;5637.267155269788;5640.0693885508435;5645.661260324394;5650.208970744017;4207.410962465318;4258.254805409103;4261.74429534229;4263.104748002954;4267.317229243306;5879.764809407747;5949.494292984971;5988.161657367885;5991.520678345809;6002.789902353396;5771.855703607275;5776.393478684678;5777.451142141658;5778.248827652378;5779.988502012047;5754.597178197486;5762.625429347079;5764.654120752768;5773.653580785166;5780.768769249183;5538.723063846711;5656.490915817596;5659.434056594308;5665.178549110274;5677.943220567741;5816.680082595498;5818.127280907897;5819.79630712923;5821.09772985188;5825;5647.6329038614;5647.802326918538;5652.971735141298;5654.6324488908085;5659.207710920392 18:40:05 INFO - PROCESS | 12880 | |5;yui.html;745.1133151549656;748.4124961904904;796.8047828282071;806.0810675829555;812.2202685421995;11492.827607585883;11643.476043578039;11716.472758725857;11723.824142637868;11746.647600571985;11034.944825275863;11217.831732524019;11342.60300889469;11354.545818167264;11430.942845285783;772.1082150116611;784.9489783164076;784.9921500785005;788.4914230321439;790.5454363740844;764.8470305938806;768.7808974442285;769.5921161784236;770.3567521119871;770.703279237492;804.244010630006;809.251442415766;809.295912556077;809.6558962440969;811.2171754257141;793.4485532554877;801.286854699318;802.3380710913491;803.935685145187;809.0897740042452;598.1028457314029;600.0369407101626;600.2886579403421;603.5533705058269;605.4581149870885;10996.06533444658;11013.889861101366;11091.44542772858;11099.112071034298;11154.219204655677;9982.251331150193;10239.488025598765;10419.687409377731;10670.466476676134;10780;9854.556544955494;10273.229507786871;10292.845607315896;10312.948435257777;10322.896771032343;3290.835458227103;3312.966870331314;3315.4860996545576;3331.3670402623425;3424.708899743525;36480.452793208126;36869.446958295644;39290;39774.801125994476;39778.80110599457;9446.952765236267;9514.952425237829;9574.904250957541;9708.077732615391;9796.51017449139;15725.292361843745;15759.133247671489;15858.52424427246;15877;15891.841081589037;6549.770758023446;6692.230393504809;6746.696398662072;6838.829029274308;6848.1097457330225;3740.3828368318923;3809.485719427897;3824.617538246209;3840.135969406917;3858.3633700439673;2624.6194301826126;2642.3262068172876;2645.404783923602;2648.0864101884818;2652.4297276085736;507.64972169203133;513.7379936232473;514.7169057018625;527.8231792349605;528.4345750047412;491.48885159433786;538.1389776357796;557.2644109775058;584.4272612839441;615.3477314047125;8289.253967142866;8663.263622592025;8664.133586641285;8920.821583568293;9010.954945225232;481.4511456939092;509.8572399728082;568.7412227436506;584.2521572387351;608.339951153004;3410.140549716644;3667.688246499024;3735.9439608405896;3738.887833364949;3746.6815320698047;44281.33577996332;44333.556664432945;44515.33227001598;44559.55440445554;44820.77589612031;39404.21191576152;40080.797576072764;40300.596994029685;40378.59621403748;40388.79805600953;33017.50473742896;35282;36779.448308275394;40332.59667403347;40355.798221009296;7792.805179870322;7925.841483170189;7966.28303452692;8116;8136.837263254583;29319;29379.85310073436;29418;29731.851340743156;30633.846830765702;35339.116522087155;35367.05481198559;35544;35669.64330356767;36015.45976810298;10065.295429319878;10254.333468324536;10318.535665894902;10414.531346089292;10472.633457828939;11299.71750706206;11495.770084598094;11520.884791152317;11547.653570392902;11555.88444115548;10512.10647094975;10838.837417438903;10983.780324393307;11094.334339939307;11132.38771867555;10280.331778434378;10669.35983840972;10774.569017239222;10801.135909127093;11063.170262230204;10205.234607404325;10476.109530689977;10931.125509959025;11418.31490110596;11447.599334023602;8783.824323513621;8834.160754728291;8915.108489151033;9033.909660903308;9050.094990500897;8842.336824738042;9137.862932056158;9269;9345.766355841159;9606.375585586915 18:40:05 INFO - PROCESS | 12880 | __end_tp_report 18:40:05 INFO - PROCESS | 12880 | __start_cc_report 18:40:05 INFO - PROCESS | 12880 | _x_x_mozilla_cycle_collect,315 18:40:05 INFO - PROCESS | 12880 | __end_cc_report 18:40:05 INFO - PROCESS | 12880 | __startTimestamp1452825605919__endTimestamp 18:40:05 INFO - PROCESS | 12880 | 18:40:05 INFO - PROCESS | 12880 | ------- Summary: start ------- 18:40:05 INFO - PROCESS | 12880 | Number of tests: 6 18:40:05 INFO - PROCESS | 12880 | 18:40:05 INFO - PROCESS | 12880 | [#0] dojo.html Cycles:165 Average:4484.89 Median:4595.63 stddev:457.79 (10.0%) stddev-sans-first:434.40 18:40:05 INFO - PROCESS | 12880 | Values: 2590.1 2621.4 2623.8 2625.2 2634.4 4416.9 4454.3 4464.4 4528.1 4564.8 4480.9 4506.7 4554.5 4589.9 4602.3 4217.3 4283.4 4333.3 4343.7 4365.9 4231.3 4241.6 4249.4 4318.8 4325.3 4113.2 4196.0 4270.7 4286.8 4296.8 4191.4 4225.7 4232.6 4236.4 4244.1 4143.2 4158.9 4170.7 4180.1 4193.8 4385.2 4425.9 4434.9 4457.8 4493.6 4823.9 4829.3 4839.5 4859.8 4888.4 4835.8 4872.0 4872.3 4882.8 4918.0 4405.7 4443.5 4480.7 4521.1 4527.8 4983.5 4985.0 5005.1 5009.1 5056.8 4757.4 4772.6 4788.9 4829.3 4863.8 4732.5 4776.9 4818.8 4820.1 4876.7 4774.0 4789.5 4820.7 4825.2 4875.4 4582.5 4753.4 4782.3 4783.8 4807.5 3987.0 3998.2 4026.7 4063.3 4065.0 3520.4 3542.4 3549.0 3559.9 3579.1 4111.4 4171.0 4192.4 4201.0 4247.9 4829.5 4884.1 4926.7 4932.0 4973.3 4210.6 4221.1 4225.6 4277.4 4288.8 4217.4 4281.4 4302.2 4310.8 4357.8 4549.3 4566.4 4588.4 4597.4 4643.0 4867.1 4885.0 4895.1 4910.8 4919.5 4437.2 4508.8 4595.6 4610.6 4613.1 4763.1 4792.2 4794.0 4798.6 4818.7 4838.9 4845.7 4867.1 4890.9 4941.4 4551.6 4617.1 4656.4 4704.2 4744.7 4724.5 4737.2 4748.7 4749.3 4798.4 4634.6 4638.6 4649.1 4662.1 4688.4 4583.1 4668.2 4677.0 4757.2 4806.4 4603.6 4637.9 4646.5 4646.9 4707.8 18:40:05 INFO - PROCESS | 12880 | 18:40:05 INFO - PROCESS | 12880 | [#1] ext.html Cycles:180 Average:39198.95 Median:35448.65 stddev:63964.61 (180.4%) stddev-sans-first:64078.04 18:40:05 INFO - PROCESS | 12880 | Values: 494.4 498.3 509.7 537.7 548.4 32409.4 33276.2 33363.8 33482.3 33516.8 35174.0 35463.3 35741.0 35758.6 35809.0 7542.5 7705.5 7716.1 7744.4 7748.6 7539.0 7678.0 7696.0 7698.7 7715.4 7830.4 7887.8 7914.7 7916.8 7926.0 7781.7 7841.8 7871.5 7888.9 7897.7 7650.4 7770.7 7801.8 7816.8 7820.6 35434.0 36042.8 36051.5 36093.0 36184.8 3144.0 3211.8 3430.9 3436.2 3739.8 27183.0 27538.7 27578.7 27839.0 28004.0 3324.4 3387.1 3389.0 3406.1 3500.7 161359.0 162069.0 162282.0 162776.0 163369.0 37948.8 38782.6 52223.7 53809.7 53825.2 36010.6 36024.3 36081.6 36117.0 36182.6 13369.8 13549.2 13701.6 13710.5 13764.5 10932.5 11085.1 11099.6 11118.6 11121.6 13072.2 13267.5 13276.5 13324.1 13396.1 5466.2 5512.7 5522.5 5559.7 5595.2 882.1 889.6 914.0 945.3 959.1 20988.2 21025.2 21097.8 21344.7 21684.5 945.1 972.7 1034.8 1041.6 1103.0 12496.8 12611.6 12702.9 12780.6 12896.2 303125.0 310553.0 311082.0 311817.0 312219.0 47824.0 48176.3 48180.0 48199.0 48253.8 1181.9 1234.8 1238.7 1251.4 1271.9 24781.3 24997.1 25124.0 25241.1 25298.7 41971.8 42700.0 42732.8 42903.4 42907.6 235974.0 237009.0 237720.0 239460.0 240220.0 38780.0 39402.6 40167.2 40570.6 41138.6 38364.2 38494.8 38752.6 39123.8 39620.6 32230.0 32302.4 32699.2 33133.7 35959.3 32669.8 33431.8 33457.2 35607.6 36065.3 35746.0 35791.6 35882.0 39026.0 39781.8 30909.0 32272.0 32825.8 32991.5 33184.5 24916.9 25917.2 26596.0 27204.3 27620.7 18:40:05 INFO - PROCESS | 12880 | 18:40:05 INFO - PROCESS | 12880 | [#2] jquery.html Cycles:180 Average:14756.91 Median:4945.52 stddev:23771.82 (480.7%) stddev-sans-first:23813.88 18:40:05 INFO - PROCESS | 12880 | Values: 346.2 348.8 352.4 355.4 356.4 13929.8 14369.3 14668.6 15386.8 16054.7 10296.7 10607.5 12663.3 15033.0 15096.8 4563.9 4604.6 4701.7 5002.3 5037.0 4947.1 5035.0 5037.0 5039.4 5044.0 4854.4 4944.0 5014.3 5143.9 5144.6 5052.4 5066.6 5112.0 5189.0 5708.7 5050.1 5071.9 5098.9 5103.1 5108.1 16180.4 17223.8 18033.6 18035.2 18116.5 1840.6 1880.4 1904.7 1942.4 1959.7 8983.4 10306.9 11452.9 12073.3 12449.9 1739.1 1749.2 1777.9 1796.0 1813.6 42636.6 42999.0 43670.6 43699.6 43999.8 9393.7 9738.8 9826.3 9837.6 9911.1 12412.5 12440.7 12446.5 12465.9 12499.3 6900.7 6992.4 7169.3 7281.4 7316.2 6877.6 6916.4 6929.2 6934.3 6938.6 4186.7 4253.2 4262.7 4272.2 4307.9 1652.2 1709.4 1740.2 1779.3 1796.1 854.5 860.5 923.6 927.2 934.1 14308.4 14741.8 14859.9 15344.4 15407.0 860.9 877.2 879.1 897.2 951.1 8428.4 8836.9 8843.6 9074.2 9240.9 132688.0 132745.3 132963.3 133162.3 133764.0 58881.7 60688.7 61857.1 62653.4 63863.0 1093.6 1106.4 1111.0 1120.4 1124.5 13623.3 13851.5 13913.8 13958.9 13971.3 29394.3 29396.6 29510.4 29557.9 30212.4 38323.6 38602.6 38784.4 39468.4 39501.6 2450.9 6449.7 6476.6 6694.2 6899.4 7885.5 9472.9 9838.4 9893.3 10022.3 8036.9 8574.8 8615.5 8685.7 8781.8 8528.6 8662.0 8882.7 8914.5 9094.4 8796.9 8835.8 8854.9 8904.2 8926.8 6326.9 6474.6 6533.9 6606.5 6848.7 7568.9 8506.6 8738.2 8756.1 8767.1 18:40:05 INFO - PROCESS | 12880 | 18:40:05 INFO - PROCESS | 12880 | [#3] mootools.html Cycles:180 Average:4693.25 Median:5723.00 stddev:2356.94 (41.2%) stddev-sans-first:2350.35 18:40:05 INFO - PROCESS | 12880 | Values: 1373.7 1383.3 1496.7 1679.7 1707.2 5820.6 5953.6 6539.0 6732.7 6755.5 6462.6 6603.8 6659.0 6659.7 6676.8 2068.6 2086.2 2091.4 2092.2 2101.1 2001.1 2004.1 2026.1 2052.4 2063.0 2010.7 2015.5 2017.1 2029.5 2036.6 2037.2 2050.5 2050.6 2058.4 2064.9 2004.2 2008.0 2030.9 2038.0 2042.3 6723.2 6780.7 6784.1 6797.6 6822.6 4022.2 4143.8 4150.9 4161.1 4162.0 2585.5 2597.7 2624.6 2689.7 2714.3 812.3 823.3 825.8 840.8 866.9 9081.8 9083.2 9123.1 9141.5 9143.8 3678.0 3683.5 3722.2 3728.1 3764.7 7906.5 7931.8 7932.9 7935.6 7940.2 4096.6 4099.5 4107.7 4120.5 4141.6 3273.1 3320.1 3597.2 3742.6 3743.4 3180.9 3210.1 3222.4 3242.9 3254.6 1011.2 1030.9 1036.2 1047.0 1049.7 1163.4 1173.1 1179.3 1197.7 1197.9 6263.9 6285.1 6302.1 6316.9 6326.2 1008.8 1021.8 1022.9 1030.2 1055.8 4943.1 5051.6 5062.9 5069.9 5091.2 7756.9 7808.4 7863.4 7994.3 8003.6 7708.8 7717.0 7743.8 7744.9 7877.0 6166.8 6222.4 6255.7 6256.2 6282.3 5914.5 5928.9 5991.7 5999.6 6001.7 6874.3 6977.6 6991.4 7024.4 7038.0 7160.1 7165.7 7173.8 7192.6 7259.6 5293.4 5455.4 5983.8 6017.4 6047.9 6192.9 6327.3 6344.7 6345.6 6351.7 5776.5 5980.9 6027.6 6045.8 6160.0 5957.8 6033.6 6108.8 6122.7 6130.4 5996.2 6130.3 6205.8 6231.1 6232.8 5515.8 5647.4 5656.0 5660.5 5671.2 5603.8 5669.9 5716.5 5719.0 5727.0 18:40:05 INFO - PROCESS | 12880 | 18:40:05 INFO - PROCESS | 12880 | [#4] prototype.html Cycles:180 Average:4800.95 Median:5491.96 stddev:1415.10 (25.8%) stddev-sans-first:1378.23 18:40:05 INFO - PROCESS | 12880 | Values: 303.9 315.7 319.5 320.1 321.0 5387.8 5473.0 5529.8 5570.7 5600.8 5367.9 5486.0 5490.0 5493.9 5494.7 4237.2 4262.0 4274.9 4281.1 4284.5 4296.7 4297.9 4301.0 4301.4 4307.7 4074.9 4195.4 4245.0 4252.9 4260.3 4201.4 4217.6 4220.8 4221.4 4233.2 3685.8 3688.0 3689.2 3692.3 3697.7 5199.7 5290.0 5304.5 5308.8 5338.9 4809.0 4827.2 4833.0 4834.0 4836.2 5799.2 5800.3 5801.2 5804.9 5812.2 3871.9 3950.8 3955.7 3957.9 3958.5 6020.8 6076.5 6082.0 6095.8 6099.5 4093.9 4126.2 4126.8 4136.4 4144.6 4173.5 4189.1 4191.1 4207.7 4209.6 4742.1 4835.1 4837.8 4841.5 4847.4 5735.9 5780.7 5792.8 5798.8 5810.0 1456.3 1481.4 1486.9 1490.1 1492.1 983.3 986.6 991.4 999.9 1010.7 5073.7 5100.9 5111.8 5117.8 5121.4 5960.6 6002.5 6009.7 6027.9 6033.2 5060.8 5113.2 5114.6 5116.4 5122.6 3164.5 3236.0 3255.3 3256.0 3277.6 5634.3 5635.8 5636.1 5639.2 5640.4 6082.6 6253.6 6254.7 6286.1 6289.7 5635.2 5672.0 5685.2 5700.5 5702.0 6075.6 6087.9 6088.6 6089.3 6098.4 5789.2 5921.9 5946.5 5958.2 5969.0 5634.9 5637.3 5640.1 5645.7 5650.2 4207.4 4258.3 4261.7 4263.1 4267.3 5879.8 5949.5 5988.2 5991.5 6002.8 5771.9 5776.4 5777.5 5778.2 5780.0 5754.6 5762.6 5764.7 5773.7 5780.8 5538.7 5656.5 5659.4 5665.2 5677.9 5816.7 5818.1 5819.8 5821.1 5825.0 5647.6 5647.8 5653.0 5654.6 5659.2 18:40:05 INFO - PROCESS | 12880 | 18:40:05 INFO - PROCESS | 12880 | [#5] yui.html Cycles:180 Average:11697.13 Median:39776.80 stddev:12522.51 (31.5%) stddev-sans-first:12530.63 18:40:05 INFO - PROCESS | 12880 | Values: 745.1 748.4 796.8 806.1 812.2 11492.8 11643.5 11716.5 11723.8 11746.6 11034.9 11217.8 11342.6 11354.5 11430.9 772.1 784.9 785.0 788.5 790.5 764.8 768.8 769.6 770.4 770.7 804.2 809.3 809.3 809.7 811.2 793.4 801.3 802.3 803.9 809.1 598.1 600.0 600.3 603.6 605.5 10996.1 11013.9 11091.4 11099.1 11154.2 9982.3 10239.5 10419.7 10670.5 10780.0 9854.6 10273.2 10292.8 10312.9 10322.9 3290.8 3313.0 3315.5 3331.4 3424.7 36480.5 36869.4 39290.0 39774.8 39778.8 9447.0 9515.0 9574.9 9708.1 9796.5 15725.3 15759.1 15858.5 15877.0 15891.8 6549.8 6692.2 6746.7 6838.8 6848.1 3740.4 3809.5 3824.6 3840.1 3858.4 2624.6 2642.3 2645.4 2648.1 2652.4 507.6 513.7 514.7 527.8 528.4 491.5 538.1 557.3 584.4 615.3 8289.3 8663.3 8664.1 8920.8 9011.0 481.5 509.9 568.7 584.3 608.3 3410.1 3667.7 3735.9 3738.9 3746.7 44281.3 44333.6 44515.3 44559.6 44820.8 39404.2 40080.8 40300.6 40378.6 40388.8 33017.5 35282.0 36779.4 40332.6 40355.8 7792.8 7925.8 7966.3 8116.0 8136.8 29319.0 29379.9 29418.0 29731.9 30633.8 35339.1 35367.1 35544.0 35669.6 36015.5 10065.3 10254.3 10318.5 10414.5 10472.6 11299.7 11495.8 11520.9 11547.7 11555.9 10512.1 10838.8 10983.8 11094.3 11132.4 10280.3 10669.4 10774.6 10801.1 11063.2 10205.2 10476.1 10931.1 11418.3 11447.6 8783.8 8834.2 8915.1 9033.9 9050.1 8842.3 9137.9 9269.0 9345.8 9606.4 18:40:05 INFO - PROCESS | 12880 | -------- Summary: end -------- 18:40:05 INFO - PROCESS | 12880 | 18:40:06 INFO - TEST-INFO | 12880: exit 0 18:40:06 INFO - TEST-OK | dromaeo_css | took 1114124ms 18:40:06 INFO - TEST-START | kraken 18:40:06 INFO - operating with platform_type : linux_ 18:40:06 INFO - Initialising browser for kraken test... 18:40:06 INFO - TEST-INFO | started process 13113 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpjs9NfO/profile http://localhost:47470/getInfo.html) 18:40:10 INFO - PROCESS | 13113 | 18:40:10 INFO - PROCESS | 13113 | (process:13184): GLib-CRITICAL **: g_path_get_basename: assertion `file_name != NULL' failed 18:40:11 INFO - PROCESS | 13113 | __metrics Screen width/height:1600/1200 18:40:11 INFO - PROCESS | 13113 | colorDepth:24 18:40:11 INFO - PROCESS | 13113 | Browser inner width/height: 1024/697 18:40:11 INFO - PROCESS | 13113 | __metrics 18:40:11 INFO - PROCESS | 13113 | JavaScript error: resource://gre/modules/PerformanceStats.jsm, line 211: NS_ERROR_NOT_AVAILABLE: Component returned failure code: 0x80040111 (NS_ERROR_NOT_AVAILABLE) [nsIPerformanceStatsService.isMonitoringJank] 18:40:12 INFO - TEST-INFO | 13113: exit 0 18:40:12 INFO - Browser initialized. 18:40:12 INFO - Running cycle 1/1 for kraken test... 18:40:12 INFO - TEST-INFO | started process 13233 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpjs9NfO/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 18:40:13 INFO - PROCESS | 13233 | 18:40:13 INFO - PROCESS | 13233 | (process:13288): GLib-CRITICAL **: g_path_get_basename: assertion `file_name != NULL' failed 18:40:24 INFO - PROCESS | 13233 | RSS: Main: 150458368 18:40:24 INFO - PROCESS | 13233 | 18:40:26 INFO - PROCESS | 13233 | Cycle 1(1): loaded http://localhost:47470/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:47470/tests/kraken/driver.html?testName=audio-beat-detection) 18:40:27 INFO - PROCESS | 13233 | RSS: Main: 150048768 18:40:27 INFO - PROCESS | 13233 | 18:40:30 INFO - PROCESS | 13233 | Cycle 1(1): loaded http://localhost:47470/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:47470/tests/kraken/driver.html?testName=audio-dft) 18:40:30 INFO - PROCESS | 13233 | RSS: Main: 152997888 18:40:30 INFO - PROCESS | 13233 | 18:40:33 INFO - PROCESS | 13233 | Cycle 1(1): loaded http://localhost:47470/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:47470/tests/kraken/driver.html?testName=audio-fft) 18:40:34 INFO - PROCESS | 13233 | RSS: Main: 145350656 18:40:34 INFO - PROCESS | 13233 | 18:40:36 INFO - PROCESS | 13233 | Cycle 1(1): loaded http://localhost:47470/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:47470/tests/kraken/driver.html?testName=audio-oscillator) 18:40:36 INFO - PROCESS | 13233 | RSS: Main: 145895424 18:40:36 INFO - PROCESS | 13233 | 18:40:39 INFO - PROCESS | 13233 | Cycle 1(1): loaded http://localhost:47470/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:47470/tests/kraken/driver.html?testName=imaging-gaussian-blur) 18:40:39 INFO - PROCESS | 13233 | RSS: Main: 148078592 18:40:39 INFO - PROCESS | 13233 | 18:40:42 INFO - PROCESS | 13233 | Cycle 1(1): loaded http://localhost:47470/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:47470/tests/kraken/driver.html?testName=imaging-darkroom) 18:40:43 INFO - PROCESS | 13233 | RSS: Main: 147787776 18:40:43 INFO - PROCESS | 13233 | 18:40:47 INFO - PROCESS | 13233 | Cycle 1(1): loaded http://localhost:47470/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:47470/tests/kraken/driver.html?testName=imaging-desaturate) 18:40:47 INFO - PROCESS | 13233 | RSS: Main: 148119552 18:40:47 INFO - PROCESS | 13233 | 18:40:50 INFO - PROCESS | 13233 | Cycle 1(1): loaded http://localhost:47470/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:47470/tests/kraken/driver.html?testName=json-parse-financial) 18:40:51 INFO - PROCESS | 13233 | RSS: Main: 148598784 18:40:51 INFO - PROCESS | 13233 | 18:40:52 INFO - PROCESS | 13233 | Cycle 1(1): loaded http://localhost:47470/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:47470/tests/kraken/driver.html?testName=json-stringify-tinderbox) 18:40:53 INFO - PROCESS | 13233 | RSS: Main: 149798912 18:40:53 INFO - PROCESS | 13233 | 18:40:55 INFO - PROCESS | 13233 | Cycle 1(1): loaded http://localhost:47470/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:47470/tests/kraken/driver.html?testName=stanford-crypto-aes) 18:40:55 INFO - PROCESS | 13233 | RSS: Main: 148811776 18:40:55 INFO - PROCESS | 13233 | 18:40:58 INFO - PROCESS | 13233 | Cycle 1(1): loaded http://localhost:47470/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:47470/tests/kraken/driver.html?testName=stanford-crypto-ccm) 18:40:58 INFO - PROCESS | 13233 | RSS: Main: 149471232 18:40:58 INFO - PROCESS | 13233 | 18:41:01 INFO - PROCESS | 13233 | Cycle 1(1): loaded http://localhost:47470/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:47470/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 18:41:01 INFO - PROCESS | 13233 | RSS: Main: 148893696 18:41:01 INFO - PROCESS | 13233 | 18:41:04 INFO - PROCESS | 13233 | Cycle 1(1): loaded http://localhost:47470/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:47470/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 18:41:05 INFO - PROCESS | 13233 | RSS: Main: 149745664 18:41:05 INFO - PROCESS | 13233 | 18:41:06 INFO - PROCESS | 13233 | Cycle 1(1): loaded http://localhost:47470/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:47470/tests/kraken/driver.html?testName=ai-astar) 18:41:07 INFO - PROCESS | 13233 | RSS: Main: 149839872 18:41:07 INFO - PROCESS | 13233 | 18:41:07 INFO - PROCESS | 13233 | __start_tp_report 18:41:07 INFO - PROCESS | 13233 | _x_x_mozilla_page_load 18:41:07 INFO - PROCESS | 13233 | _x_x_mozilla_page_load_details 18:41:07 INFO - PROCESS | 13233 | |i|pagename|runs| 18:41:07 INFO - PROCESS | 13233 | |0;ai-astar;115;111;115;114;115;126;115;116;115;115 18:41:07 INFO - PROCESS | 13233 | |1;audio-beat-detection;171;134;159;166;138;162;152;135;169;137 18:41:07 INFO - PROCESS | 13233 | |2;audio-dft;163;163;163;160;167;164;167;162;165;163 18:41:07 INFO - PROCESS | 13233 | |3;audio-fft;73;74;75;73;73;140;72;75;74;72 18:41:07 INFO - PROCESS | 13233 | |4;audio-oscillator;97;97;130;97;98;97;135;97;98;128 18:41:07 INFO - PROCESS | 13233 | |5;imaging-gaussian-blur;109;110;109;110;109;110;110;109;110;110 18:41:07 INFO - PROCESS | 13233 | |6;imaging-darkroom;148;148;148;148;148;148;148;149;147;148 18:41:07 INFO - PROCESS | 13233 | |7;imaging-desaturate;96;98;96;96;96;96;96;96;96;98 18:41:07 INFO - PROCESS | 13233 | |8;json-parse-financial;72;73;71;71;72;73;75;72;70;69 18:41:07 INFO - PROCESS | 13233 | |9;json-stringify-tinderbox;66;67;71;68;70;67;67;67;68;68 18:41:07 INFO - PROCESS | 13233 | |10;stanford-crypto-aes;88;86;85;86;84;85;85;86;85;92 18:41:07 INFO - PROCESS | 13233 | |11;stanford-crypto-ccm;130;125;136;124;128;126;125;121;130;120 18:41:07 INFO - PROCESS | 13233 | |12;stanford-crypto-pbkdf2;138;148;157;148;148;137;148;149;146;139 18:41:07 INFO - PROCESS | 13233 | |13;stanford-crypto-sha256-iterative;73;73;71;72;71;70;70;70;70;70 18:41:07 INFO - PROCESS | 13233 | __end_tp_report 18:41:07 INFO - PROCESS | 13233 | __start_cc_report 18:41:07 INFO - PROCESS | 13233 | _x_x_mozilla_cycle_collect,805 18:41:07 INFO - PROCESS | 13233 | __end_cc_report 18:41:07 INFO - PROCESS | 13233 | __startTimestamp1452825667161__endTimestamp 18:41:07 INFO - PROCESS | 13233 | 18:41:07 INFO - PROCESS | 13233 | ------- Summary: start ------- 18:41:07 INFO - PROCESS | 13233 | Number of tests: 14 18:41:07 INFO - PROCESS | 13233 | 18:41:07 INFO - PROCESS | 13233 | [#0] ai-astar Cycles:10 Average:115.70 Median:115.00 stddev:3.86 (3.4%) stddev-sans-first:4.09 18:41:07 INFO - PROCESS | 13233 | Values: 115.0 111.0 115.0 114.0 115.0 126.0 115.0 116.0 115.0 115.0 18:41:07 INFO - PROCESS | 13233 | 18:41:07 INFO - PROCESS | 13233 | [#1] audio-beat-detection Cycles:10 Average:152.30 Median:160.50 stddev:15.01 (9.4%) stddev-sans-first:14.32 18:41:07 INFO - PROCESS | 13233 | Values: 171.0 134.0 159.0 166.0 138.0 162.0 152.0 135.0 169.0 137.0 18:41:07 INFO - PROCESS | 13233 | 18:41:07 INFO - PROCESS | 13233 | [#2] audio-dft Cycles:10 Average:163.70 Median:163.50 stddev:2.16 (1.3%) stddev-sans-first:2.28 18:41:07 INFO - PROCESS | 13233 | Values: 163.0 163.0 163.0 160.0 167.0 164.0 167.0 162.0 165.0 163.0 18:41:07 INFO - PROCESS | 13233 | 18:41:07 INFO - PROCESS | 13233 | [#3] audio-fft Cycles:10 Average:80.10 Median:73.50 stddev:21.07 (28.7%) stddev-sans-first:22.19 18:41:07 INFO - PROCESS | 13233 | Values: 73.0 74.0 75.0 73.0 73.0 140.0 72.0 75.0 74.0 72.0 18:41:07 INFO - PROCESS | 13233 | 18:41:07 INFO - PROCESS | 13233 | [#4] audio-oscillator Cycles:10 Average:107.40 Median:97.00 stddev:16.38 (16.9%) stddev-sans-first:16.93 18:41:07 INFO - PROCESS | 13233 | Values: 97.0 97.0 130.0 97.0 98.0 97.0 135.0 97.0 98.0 128.0 18:41:07 INFO - PROCESS | 13233 | 18:41:07 INFO - PROCESS | 13233 | [#5] imaging-gaussian-blur Cycles:10 Average:109.60 Median:110.00 stddev:0.52 (0.5%) stddev-sans-first:0.50 18:41:07 INFO - PROCESS | 13233 | Values: 109.0 110.0 109.0 110.0 109.0 110.0 110.0 109.0 110.0 110.0 18:41:07 INFO - PROCESS | 13233 | 18:41:07 INFO - PROCESS | 13233 | [#6] imaging-darkroom Cycles:10 Average:148.00 Median:148.00 stddev:0.47 (0.3%) stddev-sans-first:0.50 18:41:07 INFO - PROCESS | 13233 | Values: 148.0 148.0 148.0 148.0 148.0 148.0 148.0 149.0 147.0 148.0 18:41:07 INFO - PROCESS | 13233 | 18:41:07 INFO - PROCESS | 13233 | [#7] imaging-desaturate Cycles:10 Average:96.40 Median:96.00 stddev:0.84 (0.9%) stddev-sans-first:0.88 18:41:07 INFO - PROCESS | 13233 | Values: 96.0 98.0 96.0 96.0 96.0 96.0 96.0 96.0 96.0 98.0 18:41:07 INFO - PROCESS | 13233 | 18:41:07 INFO - PROCESS | 13233 | [#8] json-parse-financial Cycles:10 Average:71.80 Median:72.00 stddev:1.69 (2.3%) stddev-sans-first:1.79 18:41:07 INFO - PROCESS | 13233 | Values: 72.0 73.0 71.0 71.0 72.0 73.0 75.0 72.0 70.0 69.0 18:41:07 INFO - PROCESS | 13233 | 18:41:07 INFO - PROCESS | 13233 | [#9] json-stringify-tinderbox Cycles:10 Average:67.90 Median:68.00 stddev:1.52 (2.2%) stddev-sans-first:1.45 18:41:07 INFO - PROCESS | 13233 | Values: 66.0 67.0 71.0 68.0 70.0 67.0 67.0 67.0 68.0 68.0 18:41:07 INFO - PROCESS | 13233 | 18:41:07 INFO - PROCESS | 13233 | [#10] stanford-crypto-aes Cycles:10 Average:86.20 Median:86.00 stddev:2.30 (2.7%) stddev-sans-first:2.35 18:41:07 INFO - PROCESS | 13233 | Values: 88.0 86.0 85.0 86.0 84.0 85.0 85.0 86.0 85.0 92.0 18:41:07 INFO - PROCESS | 13233 | 18:41:07 INFO - PROCESS | 13233 | [#11] stanford-crypto-ccm Cycles:10 Average:126.50 Median:127.00 stddev:4.72 (3.7%) stddev-sans-first:4.83 18:41:07 INFO - PROCESS | 13233 | Values: 130.0 125.0 136.0 124.0 128.0 126.0 125.0 121.0 130.0 120.0 18:41:07 INFO - PROCESS | 13233 | 18:41:07 INFO - PROCESS | 13233 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:145.80 Median:148.00 stddev:6.14 (4.2%) stddev-sans-first:5.83 18:41:07 INFO - PROCESS | 13233 | Values: 138.0 148.0 157.0 148.0 148.0 137.0 148.0 149.0 146.0 139.0 18:41:07 INFO - PROCESS | 13233 | 18:41:07 INFO - PROCESS | 13233 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:71.00 Median:71.00 stddev:1.25 (1.8%) stddev-sans-first:1.09 18:41:07 INFO - PROCESS | 13233 | Values: 73.0 73.0 71.0 72.0 71.0 70.0 70.0 70.0 70.0 70.0 18:41:07 INFO - PROCESS | 13233 | -------- Summary: end -------- 18:41:07 INFO - PROCESS | 13233 | 18:41:08 INFO - TEST-INFO | 13233: exit 0 18:41:08 INFO - TEST-OK | kraken | took 61457ms 18:41:08 INFO - TEST-START | v8_7 18:41:08 INFO - operating with platform_type : linux_ 18:41:08 INFO - Initialising browser for v8_7 test... 18:41:08 INFO - TEST-INFO | started process 13516 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmp6l2J85/profile http://localhost:47470/getInfo.html) 18:41:12 INFO - PROCESS | 13516 | 18:41:12 INFO - PROCESS | 13516 | (process:13588): GLib-CRITICAL **: g_path_get_basename: assertion `file_name != NULL' failed 18:41:12 INFO - PROCESS | 13516 | __metrics Screen width/height:1600/1200 18:41:12 INFO - PROCESS | 13516 | colorDepth:24 18:41:12 INFO - PROCESS | 13516 | Browser inner width/height: 1024/697 18:41:12 INFO - PROCESS | 13516 | __metrics 18:41:12 INFO - PROCESS | 13516 | JavaScript error: resource://gre/modules/PerformanceStats.jsm, line 211: NS_ERROR_NOT_AVAILABLE: Component returned failure code: 0x80040111 (NS_ERROR_NOT_AVAILABLE) [nsIPerformanceStatsService.isMonitoringJank] 18:41:13 INFO - TEST-INFO | 13516: exit 0 18:41:13 INFO - Browser initialized. 18:41:13 INFO - Running cycle 1/1 for v8_7 test... 18:41:13 INFO - TEST-INFO | started process 13637 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmp6l2J85/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/v8_7/v8.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 18:41:15 INFO - PROCESS | 13637 | 18:41:15 INFO - PROCESS | 13637 | (process:13694): GLib-CRITICAL **: g_path_get_basename: assertion `file_name != NULL' failed 18:41:25 INFO - PROCESS | 13637 | RSS: Main: 150233088 18:41:25 INFO - PROCESS | 13637 | 18:41:48 INFO - PROCESS | 13637 | Cycle 1(1): loaded http://localhost:47470/tests/v8_7/run.html (next: http://localhost:47470/tests/v8_7/run.html) 18:41:48 INFO - PROCESS | 13637 | RSS: Main: 144470016 18:41:48 INFO - PROCESS | 13637 | 18:41:48 INFO - PROCESS | 13637 | __start_tp_report 18:41:48 INFO - PROCESS | 13637 | _x_x_mozilla_page_load 18:41:48 INFO - PROCESS | 13637 | _x_x_mozilla_page_load_details 18:41:48 INFO - PROCESS | 13637 | |i|pagename|runs| 18:41:48 INFO - PROCESS | 13637 | |0;Richards;167.2800267648043 18:41:48 INFO - PROCESS | 13637 | |1;DeltaBlue;186.56716417910448 18:41:48 INFO - PROCESS | 13637 | |2;Encrypt;277.700638711469 18:41:48 INFO - PROCESS | 13637 | |3;Decrypt;5240.837696335078 18:41:48 INFO - PROCESS | 13637 | |4;RayTrace;1064.9627263045793 18:41:48 INFO - PROCESS | 13637 | |5;Earley;712.2507122507122 18:41:48 INFO - PROCESS | 13637 | |6;Boyer;12382.716049382716 18:41:48 INFO - PROCESS | 13637 | |7;RegExp;42604.166666666664 18:41:48 INFO - PROCESS | 13637 | |8;Splay;602.7727546714889 18:41:48 INFO - PROCESS | 13637 | |9;NavierStokes;4835.748792270531 18:41:48 INFO - PROCESS | 13637 | __end_tp_report 18:41:48 INFO - PROCESS | 13637 | __startTimestamp1452825708612__endTimestamp 18:41:48 INFO - PROCESS | 13637 | 18:41:48 INFO - PROCESS | 13637 | ------- Summary: start ------- 18:41:48 INFO - PROCESS | 13637 | Number of tests: 10 18:41:48 INFO - PROCESS | 13637 | 18:41:48 INFO - PROCESS | 13637 | [#0] Richards Cycles:1 Average:167.28 Median:167.28 stddev:0.00 (0.0%) 18:41:48 INFO - PROCESS | 13637 | Values: 167.3 18:41:48 INFO - PROCESS | 13637 | 18:41:48 INFO - PROCESS | 13637 | [#1] DeltaBlue Cycles:1 Average:186.57 Median:186.57 stddev:0.00 (0.0%) 18:41:48 INFO - PROCESS | 13637 | Values: 186.6 18:41:48 INFO - PROCESS | 13637 | 18:41:48 INFO - PROCESS | 13637 | [#2] Encrypt Cycles:1 Average:277.70 Median:277.70 stddev:0.00 (0.0%) 18:41:48 INFO - PROCESS | 13637 | Values: 277.7 18:41:48 INFO - PROCESS | 13637 | 18:41:48 INFO - PROCESS | 13637 | [#3] Decrypt Cycles:1 Average:5240.84 Median:5240.84 stddev:0.00 (0.0%) 18:41:48 INFO - PROCESS | 13637 | Values: 5240.8 18:41:48 INFO - PROCESS | 13637 | 18:41:48 INFO - PROCESS | 13637 | [#4] RayTrace Cycles:1 Average:1064.96 Median:1064.96 stddev:0.00 (0.0%) 18:41:48 INFO - PROCESS | 13637 | Values: 1065.0 18:41:48 INFO - PROCESS | 13637 | 18:41:48 INFO - PROCESS | 13637 | [#5] Earley Cycles:1 Average:712.25 Median:712.25 stddev:0.00 (0.0%) 18:41:48 INFO - PROCESS | 13637 | Values: 712.3 18:41:48 INFO - PROCESS | 13637 | 18:41:48 INFO - PROCESS | 13637 | [#6] Boyer Cycles:1 Average:12382.72 Median:12382.72 stddev:0.00 (0.0%) 18:41:48 INFO - PROCESS | 13637 | Values: 12382.7 18:41:48 INFO - PROCESS | 13637 | 18:41:48 INFO - PROCESS | 13637 | [#7] RegExp Cycles:1 Average:42604.17 Median:42604.17 stddev:0.00 (0.0%) 18:41:48 INFO - PROCESS | 13637 | Values: 42604.2 18:41:48 INFO - PROCESS | 13637 | 18:41:48 INFO - PROCESS | 13637 | [#8] Splay Cycles:1 Average:602.77 Median:602.77 stddev:0.00 (0.0%) 18:41:48 INFO - PROCESS | 13637 | Values: 602.8 18:41:48 INFO - PROCESS | 13637 | 18:41:48 INFO - PROCESS | 13637 | [#9] NavierStokes Cycles:1 Average:4835.75 Median:4835.75 stddev:0.00 (0.0%) 18:41:48 INFO - PROCESS | 13637 | Values: 4835.7 18:41:48 INFO - PROCESS | 13637 | -------- Summary: end -------- 18:41:48 INFO - PROCESS | 13637 | 18:41:49 INFO - TEST-INFO | 13637: exit 0 18:41:49 INFO - TEST-OK | v8_7 | took 41429ms 18:41:49 INFO - SUITE-END | took 1217s 18:41:49 INFO - Completed test suite (00:20:17) 18:41:49 INFO - Working with test: dromaeo_css 18:41:49 INFO - Generating results file: dromaeo_css 18:41:49 INFO - Working with test: kraken 18:41:49 INFO - Generating results file: kraken 18:41:49 INFO - javascript benchmark 18:41:49 INFO - Working with test: v8_7 18:41:49 INFO - Generating results file: v8_7 18:41:49 INFO - Posting result 0 of 3 to http://graphs.mozilla.org/server/collect.cgi, attempt 0 18:41:49 INFO - process_Request line: dromaeo_css graph.html#tests=[[72,94,43]] 18:41:49 INFO - process_Request line: dromaeo_css 6080.76 graph.html#tests=[[72,94,43]] 18:41:49 INFO - Posting result 1 of 3 to http://graphs.mozilla.org/server/collect.cgi, attempt 0 18:41:49 INFO - process_Request line: kraken 1542.40 graph.html#tests=[[232,94,43]] 18:41:49 INFO - Posting result 2 of 3 to http://graphs.mozilla.org/server/collect.cgi, attempt 0 18:41:49 INFO - process_Request line: v8_7 20312.40 graph.html#tests=[[230,94,43]] 18:41:49 INFO - RETURN: dromaeo_css: 6080.76 18:41:49 INFO - RETURN: kraken: 1542.40 18:41:49 INFO - RETURN: v8_7: 20312.40 18:41:49 INFO - javascript benchmark 18:41:49 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"lowerIsBetter": false, "subtests": [{"lowerIsBetter": false, "replicates": [2590.080521414899, 2621.3708709909615, 2623.790096792257, 2625.2386807825733, 2634.380920483686, 4416.911661766762, 4454.287314029756, 4464.39730636364, 4528.071745292215, 4564.794584243708, 4480.910381792362, 4506.662000349978, 4554.521775213605, 4589.908201835961, 4602.309653551969, 4217.304144816102, 4283.400323954649, 4333.328334108218, 4343.739375637456, 4365.890852728676, 4231.280682284004, 4241.618254357108, 4249.426327445802, 4318.762468064255, 4325.307950727884, 4113.177364527107, 4196.034911970233, 4270.743755374688, 4286.76422796746, 4296.763677997709, 4191.392248124005, 4225.661947044229, 4232.597903199191, 4236.406903033578, 4244.108737165199, 4143.150654115899, 4158.91682166355, 4170.72890262132, 4180.080382315886, 4193.811278492475, 4385.232584297735, 4425.889352766175, 4434.933475997863, 4457.799399027052, 4493.595576398107, 4823.927641085386, 4829.275608658694, 4839.491853355417, 4859.82990595331, 4888.41339039314, 4835.782389792468, 4871.952530205987, 4872.3422337984275, 4882.755862206911, 4917.950820491785, 4405.713628614129, 4443.533428989974, 4480.708753930984, 4521.095780843844, 4527.7736113194205, 4983.451820299837, 4984.950150498521, 5005.099082165172, 5009.12340340439, 5056.84829455117, 4757.381540399726, 4772.618190544748, 4788.904221915543, 4829.348038014823, 4863.80544778212, 4732.52674732524, 4776.880577985508, 4818.807247710052, 4820.060088282751, 4876.731779752076, 4774.0, 4789.473157952622, 4820.662553621213, 4825.179719447702, 4875.439324477659, 4582.518835522289, 4753.4295884493395, 4782.33047373368, 4783.808647654125, 4807.471178170398, 3986.963389518746, 3998.2203470323007, 4026.7181297309494, 4063.2686116499312, 4065.0040740018294, 3520.4015317396106, 3542.362374772514, 3548.964510354915, 3559.857605695795, 3579.1231148368297, 4111.403846442249, 4170.979145104255, 4192.371144328315, 4200.978995105005, 4247.87256382309, 4829.492903245108, 4884.120858245479, 4926.679765815282, 4931.9753401232765, 4973.2540118981715, 4210.59999300066, 4221.050263690645, 4225.619694227473, 4277.379779931893, 4288.785560721952, 4217.40956266123, 4281.357796330575, 4302.204092242945, 4310.849120280838, 4357.847475338348, 4549.3176023596725, 4566.4048740071885, 4588.426446694163, 4597.379353787196, 4642.976785116053, 4867.123917694849, 4884.951150488591, 4895.069936712013, 4910.8281210157475, 4919.508049195195, 4437.201303765353, 4508.819647214074, 4595.632349412106, 4610.608098311681, 4613.054323863533, 4763.095011947719, 4792.209285467999, 4793.952060479351, 4798.568128868418, 4818.734969576707, 4838.927416088691, 4845.709257444564, 4867.050925069578, 4890.853274401774, 4941.357623508921, 4551.590356867898, 4617.12274667812, 4656.41794775653, 4704.247320428715, 4744.7390393528685, 4724.456687480846, 4737.24204127338, 4748.715077095248, 4749.2876068589985, 4798.448178459522, 4634.559716826896, 4638.582527572535, 4649.116667833101, 4662.067586482649, 4688.413948256468, 4583.106294272585, 4668.206404911105, 4677.0, 4757.16749568831, 4806.375171227718, 4603.631709463168, 4637.86086417408, 4646.535346465326, 4646.93029604563, 4707.835225767081], "unit": "score", "name": "dojo.html", "value": 4456.871075800507}, {"lowerIsBetter": false, "replicates": [494.36474130741993, 498.27003439960475, 509.68144909431606, 537.7418838957303, 548.4241546376305, 32409.351812963756, 33276.16809579762, 33363.833180834095, 33482.33035339292, 33516.83241583795, 35174.0, 35463.2907341853, 35741.0, 35758.64241357586, 35809.0, 7542.472026958115, 7705.537667739954, 7716.112647045577, 7744.38044956405, 7748.6125693715085, 7539.0, 7677.961610191969, 7695.961520192419, 7698.692052317901, 7715.382769378436, 7830.412719046066, 7887.8422431551335, 7914.683412663487, 7916.841663166733, 7925.9603701981405, 7781.727639532617, 7841.764747057598, 7871.527708337518, 7888.8561158631965, 7897.723579674684, 7650.42621803367, 7770.728024519171, 7801.765947021599, 7816.804579885492, 7820.608969551499, 35434.0, 36042.81978590116, 36051.45922811134, 36093.0, 36184.81907590445, 3144.009636964349, 3211.775175737699, 3430.8970730878113, 3436.202995689752, 3739.775613463201, 27183.0, 27538.724612753816, 27578.66263574532, 27839.02563410271, 28004.0, 3324.401607710611, 3387.119348969261, 3388.9661103389144, 3406.131436483681, 3500.667436593545, 161359.0, 162069.0, 162282.0, 162776.0, 163369.0, 37948.81025594854, 38782.612173878464, 52223.73888130611, 53809.730951344995, 53825.1926221107, 36010.639893601256, 36024.279514409565, 36081.63918360835, 36117.0, 36182.638173617925, 13369.799453008212, 13549.187048777105, 13701.588952331445, 13710.45158193681, 13764.518241861486, 10932.508037138348, 11085.113190944705, 11099.556017759362, 11118.610848620421, 11121.55513779456, 13072.150310229805, 13267.535636252685, 13276.468941242436, 13324.133931294435, 13396.062275640612, 5466.180072989084, 5512.6968016758665, 5522.502974732293, 5559.749811258503, 5595.21666966625, 882.1046637662778, 889.5818965086528, 913.963441462334, 945.2532499325594, 959.0888655777039, 20988.160473581192, 21025.15899364008, 21097.78902210989, 21344.679829802564, 21684.457888552595, 945.1493655709916, 972.6741541583507, 1034.8292531732332, 1041.5885725138528, 1102.9687242428195, 12496.75006499883, 12611.558595449114, 12702.87297127017, 12780.552680656132, 12896.161749486253, 303125.0, 310553.0, 311082.0, 311817.0, 312219.0, 47824.0, 48176.27735583969, 48180.0, 48199.0, 48253.75873120612, 1181.8640856301463, 1234.7900856854355, 1238.68413554543, 1251.355551890777, 1271.9427625756864, 24781.25656230316, 24997.12510062139, 25124.0, 25241.11656092028, 25298.74701252964, 41971.79014105032, 42700.0, 42732.78633606812, 42903.35644965265, 42907.570924290354, 235974.0, 237009.0, 237720.0, 239460.0, 240220.0, 38780.0, 39402.60597393989, 40167.1966560673, 40570.59429405786, 41138.58861411468, 38364.232715346094, 38494.80752596219, 38752.6124738749, 39123.80438097791, 39620.603793961694, 32230.0, 32302.35395292128, 32699.182520437178, 33133.66866331306, 35959.28081438409, 32669.836650816593, 33431.83284083564, 33457.163570910925, 35607.64392356147, 36065.27869442649, 35746.0, 35791.64208357883, 35882.0, 39026.0, 39781.80109099552, 30909.0, 32272.0, 32825.83587082145, 32991.50512742263, 33184.50223246701, 24916.87541562353, 25917.22248332553, 26596.0, 27204.31989200286, 27620.723792761815], "unit": "score", "name": "ext.html", "value": 16275.025146005606}, {"lowerIsBetter": false, "replicates": [346.1881886975044, 348.78375407247506, 352.36750033689543, 355.42066431716296, 356.4172577835242, 13929.791053134199, 14369.2815359232, 14668.559943201695, 15386.769198462003, 16054.678906421865, 10296.691099267015, 10607.469626518681, 12663.30351830649, 15033.0, 15096.849031509682, 4563.863084107482, 4604.631629469651, 4701.7414042227665, 5002.274670172841, 5037.017781532602, 4947.060058588874, 5034.974825125888, 5037.0, 5039.420466646327, 5044.041632089909, 4854.441739200002, 4943.9752801235945, 5014.2979982802435, 5143.922841157367, 5144.588432925357, 5052.393712754475, 5066.645334826564, 5111.974440127813, 5188.9740551297, 5708.686022268774, 5050.141475949097, 5071.949280507221, 5098.898022039575, 5103.081445339837, 5108.080545501808, 16180.35278588855, 17223.827761722347, 18033.639327213383, 18035.188416521287, 18116.547086322815, 1840.6042700819255, 1880.3512788088087, 1904.7428597139346, 1942.4269840396976, 1959.6962470817045, 8983.371164018521, 10306.948465257701, 11452.854714528563, 12073.27560346382, 12449.94175495084, 1739.060907110159, 1749.212854215608, 1777.9111044447725, 1795.9820401795946, 1813.6010077782867, 42636.57363426357, 42999.0, 43670.56329436697, 43699.56300437018, 43999.78000109979, 9393.671221507215, 9738.75653108678, 9826.312158149003, 9837.55730992107, 9911.058449447435, 12412.503499860086, 12440.688982775322, 12446.502139914483, 12465.93767031159, 12499.250044997329, 6900.723971041202, 6992.405645520188, 7169.318914703095, 7281.417486601059, 7316.231795661379, 6877.58734475923, 6916.446684265246, 6929.237783843773, 6934.341237582422, 6938.5836849789175, 4186.748795072305, 4253.21315556623, 4262.744235345889, 4272.230998420314, 4307.913841723148, 1652.2151977810684, 1709.4102534625783, 1740.2255996081622, 1779.3060706324543, 1796.1109250920879, 854.5171977832629, 860.5095095795461, 923.5613083785282, 927.2165020557618, 934.0985948559537, 14308.427662893368, 14741.778873316909, 14859.851401485847, 15344.386224551115, 15407.0, 860.9139086091341, 877.2455688108349, 879.090141703334, 897.1970086772433, 951.0679534056525, 8428.367872409593, 8836.8674469883, 8843.60203790831, 9074.183323500785, 9240.8613870792, 132688.0, 132745.336273318, 132963.3351833254, 133162.33418832844, 133764.0, 58881.70559147262, 60688.69655651782, 61857.072143917874, 62653.373466265664, 63863.0, 1093.5953697131954, 1106.3804269609045, 1110.972225694348, 1120.3669926491507, 1124.516457923101, 13623.318834058457, 13851.515196968057, 13913.791293130813, 13958.860411395755, 13971.301434928417, 29394.265143371587, 29396.55905161467, 29510.40979180447, 29557.85221073881, 30212.395752084394, 38323.61676383312, 38602.6139738599, 38784.41823372708, 39468.40797388099, 39501.604983949794, 2450.9387265317796, 6449.677516124269, 6476.6114033158165, 6694.230163531256, 6899.374962557605, 7885.487443316396, 9472.857907131262, 9838.36050656705, 9893.307468477426, 10022.3485473444, 8036.919630803851, 8574.78563035929, 8615.483071015758, 8685.652573896974, 8781.780455488664, 8528.573571321285, 8662.0, 8882.689105881263, 8914.484537628488, 9094.363394562317, 8796.868046979429, 8835.823283534422, 8854.867176992222, 8904.154105359981, 8926.776830579287, 6326.8734625306315, 6474.643894585843, 6533.869322613426, 6606.471482281502, 6848.657567121524, 7568.924310757042, 8506.574671266535, 8738.169873861973, 8756.080611535697, 8767.123287671182], "unit": "score", "name": "jquery.html", "value": 7229.8683047857}, {"lowerIsBetter": false, "replicates": [1373.6771858613226, 1383.2806940390997, 1496.7305884940706, 1679.6976544222034, 1707.2488105233697, 5820.592558520894, 5953.553483488745, 6539.0, 6732.730690772375, 6755.493337999651, 6462.612243265407, 6603.768868089618, 6658.966705166467, 6659.667016649172, 6676.833079173023, 2068.6276470235316, 2086.1655337864822, 2091.393495886191, 2092.204962114394, 2101.0965284927474, 2001.1495114576246, 2004.0881398963436, 2026.0882602828785, 2052.3945436096387, 2063.030375723415, 2010.6883433067899, 2015.5162760937342, 2017.072146812468, 2029.5332073623076, 2036.6435873722114, 2037.2156719662962, 2050.507878109258, 2050.6411378008866, 2058.433930669078, 2064.876107433559, 2004.2484068474323, 2008.0461780654218, 2030.9289174878957, 2037.9694304585444, 2042.3158241988951, 6723.226828914689, 6780.72877084916, 6784.118064651564, 6797.626130562817, 6822.590644561342, 4022.235775202702, 4143.7720925349095, 4150.8547200848125, 4161.126163505667, 4162.0, 2585.482903419305, 2597.6623039005, 2624.6063090536572, 2689.6772387313454, 2714.348556346463, 812.2608426332009, 823.3289868756943, 825.7729124490753, 840.7892634606147, 866.9263112635433, 9081.818363632756, 9083.22792562633, 9123.133302336268, 9141.497217653026, 9143.77140571491, 3677.963220367762, 3683.4658974448553, 3722.218334149805, 3728.12389088564, 3764.6800021997888, 7906.52560846351, 7931.801704957422, 7932.920670793334, 7935.56354400502, 7940.245676660708, 4096.56986016464, 4099.508059032875, 4107.712460127822, 4120.464339635828, 4141.565135660772, 3273.116258610162, 3320.0869760815967, 3597.1546686528645, 3742.607026262258, 3743.3636281832155, 3180.8727650894166, 3210.1493104327374, 3222.4199644064292, 3242.886498972525, 3254.6094468663914, 1011.1506334678905, 1030.9484525773682, 1036.160709825044, 1046.9685909422728, 1049.6536143072767, 1163.3601519164426, 1173.1494666366987, 1179.31010358941, 1197.6586672798385, 1197.8921897029309, 6263.906041409383, 6285.088662143963, 6302.1177035215105, 6316.905246421307, 6326.240851097806, 1008.8184126857236, 1021.7905329407454, 1022.867027286448, 1030.2015937648382, 1055.8205105132147, 4943.060818444484, 5051.570616497565, 5062.898742025139, 5069.923951140662, 5091.1854103343285, 7756.883646745303, 7808.41436892224, 7863.370930325675, 7994.2805147537, 8003.559804210708, 7708.807279818049, 7717.0, 7743.845123097506, 7744.883826742604, 7876.960615196887, 6166.845828854314, 6222.377762223832, 6255.6872156392, 6256.249250090018, 6282.340354262737, 5914.526837853047, 5928.9110663339225, 5991.67045812467, 5999.5800293979, 6001.669908155093, 6874.312568743286, 6977.581345119106, 6991.44068474531, 7024.438044956289, 7038.014677945194, 7160.069191005136, 7165.749198778018, 7173.784786456415, 7192.568445893263, 7259.637018148966, 5293.444188360167, 5455.372632147354, 5983.820485385445, 6017.428344307284, 6047.879042419215, 6192.876142477216, 6327.303996560283, 6344.682765861596, 6345.619262844244, 6351.745930162741, 5776.537876969748, 5980.8803823924145, 6027.57806953509, 6045.78839740607, 6160.0, 5957.76168953237, 6033.607815491979, 6108.847278818065, 6122.663253520921, 6130.417610327012, 5996.220491336273, 6130.264368275835, 6205.782797602063, 6231.1276421300145, 6232.781852635136, 5515.779368825202, 5647.407022262768, 5656.038473459439, 5660.490555849993, 5671.177679236405, 5603.7758489659955, 5669.858253543694, 5716.456936591017, 5719.0277652798295, 5726.969145553674], "unit": "score", "name": "mootools.html", "value": 3912.1249562293597}, {"lowerIsBetter": false, "replicates": [303.91642298367947, 315.6590881847603, 319.51752853191675, 320.1053056706505, 320.9566708494353, 5387.838364849061, 5473.0, 5529.834104976847, 5570.721463926808, 5600.803971860985, 5367.919481207785, 5486.0, 5490.011797876381, 5493.917591236134, 5494.697791621459, 4237.152569486099, 4262.019735460846, 4274.871753847374, 4281.100968796541, 4284.528701842794, 4296.699231053827, 4297.871063868089, 4300.97849510752, 4301.419308393374, 4307.719998200123, 4074.9388759168637, 4195.370694395834, 4244.957550424502, 4252.936205956913, 4260.275753121961, 4201.43280657112, 4217.6204141627095, 4220.78896055199, 4221.430106935571, 4233.23801715691, 3685.760425572329, 3688.0, 3689.2068205335713, 3692.2615476904457, 3697.7226707997006, 5199.662021968597, 5290.021346050993, 5304.522592966651, 5308.787648494055, 5338.893222135574, 4808.951910480921, 4827.155247831615, 4832.951670483285, 4834.0, 4836.177849765549, 5799.246098007275, 5800.331847350224, 5801.24583804107, 5804.9419505805245, 5812.186293918855, 3871.903202419962, 3950.822213000422, 3955.663768579674, 3957.881263562098, 3958.485396898385, 6020.789272375446, 6076.453119219292, 6081.969590152065, 6095.786647467362, 6099.5425343099005, 4093.8976525586504, 4126.174765047002, 4126.773027483518, 4136.358864376027, 4144.647704945113, 4173.52004519478, 4189.120284740177, 4191.140816132685, 4207.705460617789, 4209.5579964103945, 4742.112971539386, 4835.0571638530855, 4837.782299796518, 4841.515848415201, 4847.418309802846, 5735.8566035849435, 5780.71096445176, 5792.768289268382, 5798.797042103591, 5810.0, 1456.3373664982619, 1481.4370539195038, 1486.8736157426524, 1490.1059364381501, 1492.1420183394591, 983.341161421849, 986.6300137448457, 991.3754334769194, 999.9350042247231, 1010.7321559786662, 5073.695578265242, 5100.948990510122, 5111.795528178905, 5117.769700363493, 5121.411037730634, 5960.552958528127, 6002.549808764273, 6009.699515024231, 6027.8794424111275, 6033.215681961405, 5060.797568097235, 5113.207452844815, 5114.64197506171, 5116.360454943132, 5122.564582010496, 3164.47786115293, 3236.0, 3255.348930213919, 3256.0394683568406, 3277.6066871975518, 5634.32388113429, 5635.802746903839, 5636.126400407943, 5639.154126881001, 5640.351359593617, 6082.635041897501, 6253.5622506425025, 6254.718537665725, 6286.088517164985, 6289.685515724195, 5635.21107045014, 5672.0, 5685.204071430003, 5700.543956483554, 5702.030654788696, 6075.605085669417, 6087.9391206087375, 6088.634681919099, 6089.269287685506, 6098.390160983866, 5789.189513468202, 5921.881562368642, 5946.524278057832, 5958.19564358806, 5969.04495280753, 5634.943650563606, 5637.267155269788, 5640.0693885508435, 5645.661260324394, 5650.208970744017, 4207.410962465318, 4258.254805409103, 4261.74429534229, 4263.104748002954, 4267.317229243306, 5879.764809407747, 5949.494292984971, 5988.161657367885, 5991.520678345809, 6002.789902353396, 5771.855703607275, 5776.393478684678, 5777.451142141658, 5778.248827652378, 5779.988502012047, 5754.597178197486, 5762.625429347079, 5764.654120752768, 5773.653580785166, 5780.768769249183, 5538.723063846711, 5656.490915817596, 5659.434056594308, 5665.178549110274, 5677.943220567741, 5816.680082595498, 5818.127280907897, 5819.79630712923, 5821.09772985188, 5825.0, 5647.6329038614, 5647.802326918538, 5652.971735141298, 5654.6324488908085, 5659.207710920392], "unit": "score", "name": "prototype.html", "value": 4345.50602101837}, {"lowerIsBetter": false, "replicates": [745.1133151549656, 748.4124961904904, 796.8047828282071, 806.0810675829555, 812.2202685421995, 11492.827607585883, 11643.476043578039, 11716.472758725857, 11723.824142637868, 11746.647600571985, 11034.944825275863, 11217.831732524019, 11342.60300889469, 11354.545818167264, 11430.942845285783, 772.1082150116611, 784.9489783164076, 784.9921500785005, 788.4914230321439, 790.5454363740844, 764.8470305938806, 768.7808974442285, 769.5921161784236, 770.3567521119871, 770.703279237492, 804.244010630006, 809.251442415766, 809.295912556077, 809.6558962440969, 811.2171754257141, 793.4485532554877, 801.286854699318, 802.3380710913491, 803.935685145187, 809.0897740042452, 598.1028457314029, 600.0369407101626, 600.2886579403421, 603.5533705058269, 605.4581149870885, 10996.06533444658, 11013.889861101366, 11091.44542772858, 11099.112071034298, 11154.219204655677, 9982.251331150193, 10239.488025598765, 10419.687409377731, 10670.466476676134, 10780.0, 9854.556544955494, 10273.229507786871, 10292.845607315896, 10312.948435257777, 10322.896771032343, 3290.835458227103, 3312.966870331314, 3315.4860996545576, 3331.3670402623425, 3424.708899743525, 36480.452793208126, 36869.446958295644, 39290.0, 39774.801125994476, 39778.80110599457, 9446.952765236267, 9514.952425237829, 9574.904250957541, 9708.077732615391, 9796.51017449139, 15725.292361843745, 15759.133247671489, 15858.52424427246, 15877.0, 15891.841081589037, 6549.770758023446, 6692.230393504809, 6746.696398662072, 6838.829029274308, 6848.1097457330225, 3740.3828368318923, 3809.485719427897, 3824.617538246209, 3840.135969406917, 3858.3633700439673, 2624.6194301826126, 2642.3262068172876, 2645.404783923602, 2648.0864101884818, 2652.4297276085736, 507.64972169203133, 513.7379936232473, 514.7169057018625, 527.8231792349605, 528.4345750047412, 491.48885159433786, 538.1389776357796, 557.2644109775058, 584.4272612839441, 615.3477314047125, 8289.253967142866, 8663.263622592025, 8664.133586641285, 8920.821583568293, 9010.954945225232, 481.4511456939092, 509.8572399728082, 568.7412227436506, 584.2521572387351, 608.339951153004, 3410.140549716644, 3667.688246499024, 3735.9439608405896, 3738.887833364949, 3746.6815320698047, 44281.33577996332, 44333.556664432945, 44515.33227001598, 44559.55440445554, 44820.77589612031, 39404.21191576152, 40080.797576072764, 40300.596994029685, 40378.59621403748, 40388.79805600953, 33017.50473742896, 35282.0, 36779.448308275394, 40332.59667403347, 40355.798221009296, 7792.805179870322, 7925.841483170189, 7966.28303452692, 8116.0, 8136.837263254583, 29319.0, 29379.85310073436, 29418.0, 29731.851340743156, 30633.846830765702, 35339.116522087155, 35367.05481198559, 35544.0, 35669.64330356767, 36015.45976810298, 10065.295429319878, 10254.333468324536, 10318.535665894902, 10414.531346089292, 10472.633457828939, 11299.71750706206, 11495.770084598094, 11520.884791152317, 11547.653570392902, 11555.88444115548, 10512.10647094975, 10838.837417438903, 10983.780324393307, 11094.334339939307, 11132.38771867555, 10280.331778434378, 10669.35983840972, 10774.569017239222, 10801.135909127093, 11063.170262230204, 10205.234607404325, 10476.109530689977, 10931.125509959025, 11418.31490110596, 11447.599334023602, 8783.824323513621, 8834.160754728291, 8915.108489151033, 9033.909660903308, 9050.094990500897, 8842.336824738042, 9137.862932056158, 9269.0, 9345.766355841159, 9606.375585586915], "unit": "score", "name": "yui.html", "value": 5669.817724185581}], "name": "dromaeo_css", "value": 6080.760771998812}, {"lowerIsBetter": true, "subtests": [{"lowerIsBetter": true, "replicates": [115.0, 111.0, 115.0, 114.0, 115.0, 126.0, 115.0, 116.0, 115.0, 115.0], "unit": "score", "name": "ai-astar", "value": 115.7}, {"lowerIsBetter": true, "replicates": [171.0, 134.0, 159.0, 166.0, 138.0, 162.0, 152.0, 135.0, 169.0, 137.0], "unit": "score", "name": "audio-beat-detection", "value": 152.3}, {"lowerIsBetter": true, "replicates": [163.0, 163.0, 163.0, 160.0, 167.0, 164.0, 167.0, 162.0, 165.0, 163.0], "unit": "score", "name": "audio-dft", "value": 163.7}, {"lowerIsBetter": true, "replicates": [73.0, 74.0, 75.0, 73.0, 73.0, 140.0, 72.0, 75.0, 74.0, 72.0], "unit": "score", "name": "audio-fft", "value": 80.1}, {"lowerIsBetter": true, "replicates": [97.0, 97.0, 130.0, 97.0, 98.0, 97.0, 135.0, 97.0, 98.0, 128.0], "unit": "score", "name": "audio-oscillator", "value": 107.4}, {"lowerIsBetter": true, "replicates": [109.0, 110.0, 109.0, 110.0, 109.0, 110.0, 110.0, 109.0, 110.0, 110.0], "unit": "score", "name": "imaging-gaussian-blur", "value": 109.6}, {"lowerIsBetter": true, "replicates": [148.0, 148.0, 148.0, 148.0, 148.0, 148.0, 148.0, 149.0, 147.0, 148.0], "unit": "score", "name": "imaging-darkroom", "value": 148.0}, {"lowerIsBetter": true, "replicates": [96.0, 98.0, 96.0, 96.0, 96.0, 96.0, 96.0, 96.0, 96.0, 98.0], "unit": "score", "name": "imaging-desaturate", "value": 96.4}, {"lowerIsBetter": true, "replicates": [72.0, 73.0, 71.0, 71.0, 72.0, 73.0, 75.0, 72.0, 70.0, 69.0], "unit": "score", "name": "json-parse-financial", "value": 71.8}, {"lowerIsBetter": true, "replicates": [66.0, 67.0, 71.0, 68.0, 70.0, 67.0, 67.0, 67.0, 68.0, 68.0], "unit": "score", "name": "json-stringify-tinderbox", "value": 67.9}, {"lowerIsBetter": true, "replicates": [88.0, 86.0, 85.0, 86.0, 84.0, 85.0, 85.0, 86.0, 85.0, 92.0], "unit": "score", "name": "stanford-crypto-aes", "value": 86.2}, {"lowerIsBetter": true, "replicates": [130.0, 125.0, 136.0, 124.0, 128.0, 126.0, 125.0, 121.0, 130.0, 120.0], "unit": "score", "name": "stanford-crypto-ccm", "value": 126.5}, {"lowerIsBetter": true, "replicates": [138.0, 148.0, 157.0, 148.0, 148.0, 137.0, 148.0, 149.0, 146.0, 139.0], "unit": "score", "name": "stanford-crypto-pbkdf2", "value": 145.8}, {"lowerIsBetter": true, "replicates": [73.0, 73.0, 71.0, 72.0, 71.0, 70.0, 70.0, 70.0, 70.0, 70.0], "unit": "score", "name": "stanford-crypto-sha256-iterative", "value": 71.0}], "name": "kraken", "value": 1542.4}, {"lowerIsBetter": false, "subtests": [{"lowerIsBetter": false, "replicates": [167.2800267648043], "unit": "score", "name": "Richards", "value": 211.03535600000004}, {"lowerIsBetter": false, "replicates": [186.56716417910448], "unit": "score", "name": "DeltaBlue", "value": 354.39248}, {"lowerIsBetter": false, "replicates": [277.700638711469], "unit": "score", "name": "Encrypt", "value": 958.5177809999998}, {"lowerIsBetter": false, "replicates": [5240.837696335078], "unit": "score", "name": "Decrypt", "value": 50.78978121878119}, {"lowerIsBetter": false, "replicates": [1064.9627263045793], "unit": "score", "name": "RayTrace", "value": 694.8496709999997}, {"lowerIsBetter": false, "replicates": [712.2507122507122], "unit": "score", "name": "Earley", "value": 935.7140519999998}, {"lowerIsBetter": false, "replicates": [12382.716049382716], "unit": "score", "name": "Boyer", "value": 53.822036889332054}, {"lowerIsBetter": false, "replicates": [42604.166666666664], "unit": "score", "name": "RegExp", "value": 21.382533007334946}, {"lowerIsBetter": false, "replicates": [602.7727546714889], "unit": "score", "name": "Splay", "value": 135.19356900000005}, {"lowerIsBetter": false, "replicates": [4835.748792270531], "unit": "score", "name": "NavierStokes", "value": 306.881118881119}], "name": "v8_7", "value": 20312.397365648285}]} 18:41:49 INFO - TinderboxPrint: TalosResult: {"graphserver": {"v8_7": {"url": "http://graphs.mozilla.org/graph.html#tests=[[230,94,43]]", "result": "20312.40"}, "kraken": {"url": "http://graphs.mozilla.org/graph.html#tests=[[232,94,43]]", "result": "1542.40"}, "dromaeo_css": {"url": "http://graphs.mozilla.org/graph.html#tests=[[72,94,43]]", "result": "6080.76"}}} 18:41:49 INFO - Return code: 0 18:41:49 INFO - Validating PERFHERDER_DATA against /builds/slave/test/build/tests/talos/treeherder-schemas/performance-artifact.json 18:41:49 INFO - # TBPL SUCCESS # 18:41:49 INFO - Running post-action listener: _resource_record_post_action 18:41:49 INFO - Running post-run listener: _resource_record_post_run 18:41:50 INFO - Total resource usage - Wall time: 1234s; CPU: 13.0%; Read bytes: 8192; Write bytes: 559009792; Read time: 280; Write time: 509356 18:41:50 INFO - install - Wall time: 16s; CPU: 14.0%; Read bytes: 4096; Write bytes: 170545152; Read time: 104; Write time: 252124 18:41:50 INFO - run-tests - Wall time: 1219s; CPU: 13.0%; Read bytes: 4096; Write bytes: 310894592; Read time: 176; Write time: 205640 18:41:50 INFO - Running post-run listener: _upload_blobber_files 18:41:50 INFO - Blob upload gear active. 18:41:50 INFO - Preparing to upload files from /builds/slave/test/build/blobber_upload_dir. 18:41:50 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 18:41:50 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', 'Firefox-Non-PGO', '-d', '/builds/slave/test/build/blobber_upload_dir', '--output-manifest', '/builds/slave/test/build/uploaded_files.json'] 18:41:50 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 Firefox-Non-PGO -d /builds/slave/test/build/blobber_upload_dir --output-manifest /builds/slave/test/build/uploaded_files.json 18:41:51 INFO - (blobuploader) - INFO - Open directory for files ... 18:41:51 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log ... 18:41:51 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 18:41:51 INFO - (blobuploader) - INFO - Uploading, attempt #1. 18:41:52 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_errorsummary.log: uploaded 18:41:52 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 18:41:52 INFO - (blobuploader) - INFO - Done attempting. 18:41:52 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log ... 18:41:52 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 18:41:52 INFO - (blobuploader) - INFO - Uploading, attempt #1. 18:41:53 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_raw.log: uploaded 18:41:53 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 18:41:53 INFO - (blobuploader) - INFO - Done attempting. 18:41:53 INFO - (blobuploader) - INFO - Iteration through files over. 18:41:53 INFO - Return code: 0 18:41:53 INFO - rmtree: /builds/slave/test/build/uploaded_files.json 18:41:53 INFO - retry: Calling remove with args: ('/builds/slave/test/build/uploaded_files.json',), kwargs: {}, attempt #1 18:41:53 INFO - Setting buildbot property blobber_files to {"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/74da7142d9a15812e84105bd9d9cf800d008532cd5513b91f593f7b47a23afae44048b030286d54e17ad68f866f2b04b24ddf679e0ebd7e3d82f7f21fe639670", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/8fdf98ab11e6944755d345ab72c1554907ead48a4fe4af9a4a48ea7fa50adc60a300dfbc5d796f88611b6f957f92fe6a411fd55c121e1d334d2b37f42fac06e1"} 18:41:53 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test/properties/blobber_files 18:41:53 INFO - Writing to file /builds/slave/test/properties/blobber_files 18:41:53 INFO - Contents: 18:41:53 INFO - blobber_files:{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/74da7142d9a15812e84105bd9d9cf800d008532cd5513b91f593f7b47a23afae44048b030286d54e17ad68f866f2b04b24ddf679e0ebd7e3d82f7f21fe639670", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/8fdf98ab11e6944755d345ab72c1554907ead48a4fe4af9a4a48ea7fa50adc60a300dfbc5d796f88611b6f957f92fe6a411fd55c121e1d334d2b37f42fac06e1"} 18:41:53 INFO - Copying logs to upload dir... 18:41:53 INFO - mkdir: /builds/slave/test/build/upload/logs program finished with exit code 0 elapsedTime=1276.474112 ========= master_lag: 0.02 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 21 mins, 16 secs) (at 2016-01-14 18:41:53.222239) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-01-14 18:41:53.229832) ========= 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=ed14279e38b05397cf4aa391000001a4-1452821364.736606-2006632967 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False blobber_files:{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/74da7142d9a15812e84105bd9d9cf800d008532cd5513b91f593f7b47a23afae44048b030286d54e17ad68f866f2b04b24ddf679e0ebd7e3d82f7f21fe639670", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/8fdf98ab11e6944755d345ab72c1554907ead48a4fe4af9a4a48ea7fa50adc60a300dfbc5d796f88611b6f957f92fe6a411fd55c121e1d334d2b37f42fac06e1"} build_url:https://queue.taskcluster.net/v1/task/EIKdsMZ6RPmyPTx6I7Y_yA/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.tar.bz2 program finished with exit code 0 elapsedTime=0.011148 build_url: 'https://queue.taskcluster.net/v1/task/EIKdsMZ6RPmyPTx6I7Y_yA/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.tar.bz2' blobber_files: '{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/74da7142d9a15812e84105bd9d9cf800d008532cd5513b91f593f7b47a23afae44048b030286d54e17ad68f866f2b04b24ddf679e0ebd7e3d82f7f21fe639670", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/8fdf98ab11e6944755d345ab72c1554907ead48a4fe4af9a4a48ea7fa50adc60a300dfbc5d796f88611b6f957f92fe6a411fd55c121e1d334d2b37f42fac06e1"}' ========= master_lag: 0.02 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-01-14 18:41:53.259131) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-01-14 18:41:53.259937) ========= 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=ed14279e38b05397cf4aa391000001a4-1452821364.736606-2006632967 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004596 ========= master_lag: 0.08 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-01-14 18:41:53.340662) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2016-01-14 18:41:53.340997) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2016-01-14 18:41:53.341294) ========= ========= Total master_lag: 0.25 =========