builder: mozilla-aurora_ubuntu64_hw_test-dromaeojs-e10s-pgo slave: talos-linux64-ix-039 starttime: 1474121998.63 results: success (0) buildid: 20160917004009 builduid: 39c0864104644d618a468a713b19f1a0 revision: b9499912b32324acd84792bf02b533b40e98e496 ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2016-09-17 07:19:58.630439) ========= master: http://buildbot-master104.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2016-09-17 07:19:58.631509) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-09-17 07:19:58.632686) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-09-17 07:19:58.650110) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-09-17 07:19:58.650526) ========= 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=5bd038846534b2fdfa68eeae000001e2-1474121999.168975-1245787711 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2016-09-17 07:19:59-- https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py Resolving hg.mozilla.org (hg.mozilla.org)... 63.245.215.25, 63.245.215.102 Connecting to hg.mozilla.org (hg.mozilla.org)|63.245.215.25|:443... connected. HTTP request sent, awaiting response... 200 Script output follows Length: 12141 (12K) [text/x-python] Saving to: `archiver_client.py' 0K .......... . 100% 46.5M=0s 2016-09-17 07:20:00 (46.5 MB/s) - `archiver_client.py' saved [12141/12141] program finished with exit code 0 elapsedTime=0.134835 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-09-17 07:19:58.799905) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-09-17 07:19:58.800309) ========= rm -rf scripts properties in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['rm', '-rf', 'scripts', 'properties'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=5bd038846534b2fdfa68eeae000001e2-1474121999.168975-1245787711 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.016216 ========= master_lag: 0.03 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-09-17 07:19:58.850303) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-09-17 07:19:58.850753) ========= bash -c 'python archiver_client.py mozharness --repo releases/mozilla-aurora --rev b9499912b32324acd84792bf02b533b40e98e496 --destination scripts --debug' in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', u'python archiver_client.py mozharness --repo releases/mozilla-aurora --rev b9499912b32324acd84792bf02b533b40e98e496 --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=5bd038846534b2fdfa68eeae000001e2-1474121999.168975-1245787711 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2016-09-17 07:20:00,142 truncating revision to first 12 chars 2016-09-17 07:20:00,142 Setting DEBUG logging. 2016-09-17 07:20:00,142 attempt 1/10 2016-09-17 07:20:00,142 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/releases/mozilla-aurora/b9499912b323?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2016-09-17 07:20:00,542 unpacking tar archive at: mozilla-aurora-b9499912b323/testing/mozharness/ program finished with exit code 0 elapsedTime=0.708837 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-09-17 07:19:59.576221) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-09-17 07:19:59.576669) ========= script_repo_revision: b9499912b32324acd84792bf02b533b40e98e496 ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-09-17 07:19:59.577171) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-09-17 07:19:59.577567) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-09-17 07:19:59.587747) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 27 mins, 56 secs) (at 2016-09-17 07:19:59.588084) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Mozilla-Aurora --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Mozilla-Aurora 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', 'Mozilla-Aurora', '--cfg', 'talos/linux_config.py', '--download-symbols', 'ondemand', '--use-talos-json', '--blob-upload-branch', 'Mozilla-Aurora'] 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=5bd038846534b2fdfa68eeae000001e2-1474121999.168975-1245787711 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 07:20:00 INFO - MultiFileLogger online at 20160917 07:20:00 in /builds/slave/test 07:20:00 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Mozilla-Aurora --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Mozilla-Aurora 07:20:00 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 07:20:00 INFO - {'append_to_log': False, 07:20:00 INFO - 'base_work_dir': '/builds/slave/test', 07:20:00 INFO - 'blob_upload_branch': 'Mozilla-Aurora', 07:20:00 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 07:20:00 INFO - 'branch': 'Mozilla-Aurora', 07:20:00 INFO - 'buildbot_json_path': 'buildprops.json', 07:20:00 INFO - 'config_files': ('talos/linux_config.py',), 07:20:00 INFO - 'default_actions': ('clobber', 07:20:00 INFO - 'read-buildbot-config', 07:20:00 INFO - 'download-and-extract', 07:20:00 INFO - 'populate-webroot', 07:20:00 INFO - 'create-virtualenv', 07:20:00 INFO - 'install', 07:20:00 INFO - 'run-tests'), 07:20:00 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 07:20:00 INFO - 'download_minidump_stackwalk': True, 07:20:00 INFO - 'download_symbols': 'ondemand', 07:20:00 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 07:20:00 INFO - 'tooltool.py': '/tools/tooltool.py', 07:20:00 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 07:20:00 INFO - '/tools/misc-python/virtualenv.py')}, 07:20:00 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 07:20:00 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 07:20:00 INFO - 'installer_path': 'installer.exe', 07:20:00 INFO - 'log_level': 'info', 07:20:00 INFO - 'log_name': 'talos', 07:20:00 INFO - 'log_to_console': True, 07:20:00 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 07:20:00 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 07:20:00 INFO - 'opt_config_files': (), 07:20:00 INFO - 'pip_index': False, 07:20:00 INFO - 'sps_profile': False, 07:20:00 INFO - 'sps_profile_interval': 0, 07:20:00 INFO - 'suite': 'dromaeojs-e10s', 07:20:00 INFO - 'system_bits': '32', 07:20:00 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 07:20:00 INFO - 'title': 'talos-linux64-ix-039', 07:20:00 INFO - 'tooltool_cache': '/builds/tooltool_cache', 07:20:00 INFO - 'use_talos_json': True, 07:20:00 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 07:20:00 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 07:20:00 INFO - 'work_dir': 'build'} 07:20:00 INFO - [mozharness: 2016-09-17 14:20:00.973931Z] Running clobber step. 07:20:00 INFO - Running pre-action listener: _resource_record_pre_action 07:20:00 INFO - Running main action method: clobber 07:20:00 INFO - rmtree: /builds/slave/test/build 07:20:00 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 07:20:01 INFO - Running post-action listener: _resource_record_post_action 07:20:01 INFO - [mozharness: 2016-09-17 14:20:01.465667Z] Finished clobber step (success) 07:20:01 INFO - [mozharness: 2016-09-17 14:20:01.465768Z] Running read-buildbot-config step. 07:20:01 INFO - Running pre-action listener: _resource_record_pre_action 07:20:01 INFO - Running main action method: read_buildbot_config 07:20:01 INFO - Using buildbot properties: 07:20:01 INFO - { 07:20:01 INFO - "project": "", 07:20:01 INFO - "product": "firefox", 07:20:01 INFO - "script_repo_revision": "production", 07:20:01 INFO - "builddir": "mozilla-aurora_ubuntu64_hw_test-dromaeojs-e10s", 07:20:01 INFO - "repository": "", 07:20:01 INFO - "buildername": "Ubuntu HW 12.04 x64 mozilla-aurora pgo talos dromaeojs-e10s", 07:20:01 INFO - "buildid": "20160917004009", 07:20:01 INFO - "stage_platform": "linux64-pgo", 07:20:01 INFO - "basedir": "/builds/slave/test", 07:20:01 INFO - "nightly_build": "True", 07:20:01 INFO - "buildnumber": 508, 07:20:01 INFO - "slavename": "talos-linux64-ix-039", 07:20:01 INFO - "master": "http://buildbot-master104.bb.releng.scl3.mozilla.com:8201/", 07:20:01 INFO - "platform": "ubuntu64_hw", 07:20:01 INFO - "scheduler": "tests-mozilla-aurora-linux64-pgo-talos", 07:20:01 INFO - "branch": "mozilla-aurora", 07:20:01 INFO - "repo_path": "releases/mozilla-aurora", 07:20:01 INFO - "revision": "b9499912b32324acd84792bf02b533b40e98e496", 07:20:01 INFO - "pgo_build": "True", 07:20:01 INFO - "builduid": "39c0864104644d618a468a713b19f1a0", 07:20:01 INFO - "slavebuilddir": "test" 07:20:01 INFO - } 07:20:01 INFO - Found installer url https://queue.taskcluster.net/v1/task/dEe2JI-8Qv2bXOdj8oNC1w/artifacts/public/build/firefox-50.0a2.en-US.linux-x86_64.tar.bz2. 07:20:01 INFO - Running post-action listener: _resource_record_post_action 07:20:01 INFO - [mozharness: 2016-09-17 14:20:01.468290Z] Finished read-buildbot-config step (success) 07:20:01 INFO - [mozharness: 2016-09-17 14:20:01.468378Z] Running download-and-extract step. 07:20:01 INFO - Running pre-action listener: _resource_record_pre_action 07:20:01 INFO - Running main action method: download_and_extract 07:20:01 INFO - mkdir: /builds/slave/test/build/tests 07:20:01 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')]} 07:20:01 INFO - https://queue.taskcluster.net/v1/task/dEe2JI-8Qv2bXOdj8oNC1w/artifacts/public/build/firefox-50.0a2.en-US.linux-x86_64.test_packages.json matches https://queue.taskcluster.net 07:20:01 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/dEe2JI-8Qv2bXOdj8oNC1w/artifacts/public/build/firefox-50.0a2.en-US.linux-x86_64.test_packages.json 07:20:01 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/dEe2JI-8Qv2bXOdj8oNC1w/artifacts/public/build/firefox-50.0a2.en-US.linux-x86_64.test_packages.json 07:20:01 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/dEe2JI-8Qv2bXOdj8oNC1w/artifacts/public/build/firefox-50.0a2.en-US.linux-x86_64.test_packages.json to /builds/slave/test/build/firefox-50.0a2.en-US.linux-x86_64.test_packages.json 07:20:01 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/dEe2JI-8Qv2bXOdj8oNC1w/artifacts/public/build/firefox-50.0a2.en-US.linux-x86_64.test_packages.json', 'file_name': '/builds/slave/test/build/firefox-50.0a2.en-US.linux-x86_64.test_packages.json'}, attempt #1 07:20:01 WARNING - Server returned status 404 HTTP Error 404: Not Found for http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/dEe2JI-8Qv2bXOdj8oNC1w/artifacts/public/build/firefox-50.0a2.en-US.linux-x86_64.test_packages.json 07:20:01 INFO - retry: attempt #1 caught exception: HTTP Error 404: Not Found 07:20:01 INFO - retry: Failed, sleeping 30 seconds before retrying 07:20:31 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/dEe2JI-8Qv2bXOdj8oNC1w/artifacts/public/build/firefox-50.0a2.en-US.linux-x86_64.test_packages.json', 'file_name': '/builds/slave/test/build/firefox-50.0a2.en-US.linux-x86_64.test_packages.json'}, attempt #2 07:20:31 WARNING - Server returned status 404 HTTP Error 404: Not Found for http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/dEe2JI-8Qv2bXOdj8oNC1w/artifacts/public/build/firefox-50.0a2.en-US.linux-x86_64.test_packages.json 07:20:31 INFO - retry: attempt #2 caught exception: HTTP Error 404: Not Found 07:20:31 INFO - retry: Failed, sleeping 60 seconds before retrying 07:21:31 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/dEe2JI-8Qv2bXOdj8oNC1w/artifacts/public/build/firefox-50.0a2.en-US.linux-x86_64.test_packages.json', 'file_name': '/builds/slave/test/build/firefox-50.0a2.en-US.linux-x86_64.test_packages.json'}, attempt #3 07:21:31 WARNING - Server returned status 404 HTTP Error 404: Not Found for http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/dEe2JI-8Qv2bXOdj8oNC1w/artifacts/public/build/firefox-50.0a2.en-US.linux-x86_64.test_packages.json 07:21:31 INFO - retry: attempt #3 caught exception: HTTP Error 404: Not Found 07:21:31 INFO - Can't download from http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/dEe2JI-8Qv2bXOdj8oNC1w/artifacts/public/build/firefox-50.0a2.en-US.linux-x86_64.test_packages.json to /builds/slave/test/build/firefox-50.0a2.en-US.linux-x86_64.test_packages.json! 07:21:31 INFO - Caught exception: HTTP Error 404: Not Found 07:21:31 INFO - Caught exception: HTTP Error 404: Not Found 07:21:31 INFO - Caught exception: HTTP Error 404: Not Found 07:21:31 INFO - trying https://queue.taskcluster.net/v1/task/dEe2JI-8Qv2bXOdj8oNC1w/artifacts/public/build/firefox-50.0a2.en-US.linux-x86_64.test_packages.json 07:21:31 INFO - Downloading https://queue.taskcluster.net/v1/task/dEe2JI-8Qv2bXOdj8oNC1w/artifacts/public/build/firefox-50.0a2.en-US.linux-x86_64.test_packages.json to /builds/slave/test/build/firefox-50.0a2.en-US.linux-x86_64.test_packages.json 07:21:31 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/dEe2JI-8Qv2bXOdj8oNC1w/artifacts/public/build/firefox-50.0a2.en-US.linux-x86_64.test_packages.json', 'file_name': '/builds/slave/test/build/firefox-50.0a2.en-US.linux-x86_64.test_packages.json'}, attempt #1 07:21:32 INFO - Downloaded 1361 bytes. 07:21:32 INFO - Reading from file /builds/slave/test/build/firefox-50.0a2.en-US.linux-x86_64.test_packages.json 07:21:32 INFO - Using the following test package requirements: 07:21:32 INFO - {u'common': [u'firefox-50.0a2.en-US.linux-x86_64.common.tests.zip'], 07:21:32 INFO - u'cppunittest': [u'firefox-50.0a2.en-US.linux-x86_64.common.tests.zip', 07:21:32 INFO - u'firefox-50.0a2.en-US.linux-x86_64.cppunittest.tests.zip'], 07:21:32 INFO - u'gtest': [u'firefox-50.0a2.en-US.linux-x86_64.common.tests.zip', 07:21:32 INFO - u'firefox-50.0a2.en-US.linux-x86_64.gtest.tests.zip'], 07:21:32 INFO - u'jittest': [u'firefox-50.0a2.en-US.linux-x86_64.common.tests.zip', 07:21:32 INFO - u'jsshell-linux-x86_64.zip'], 07:21:32 INFO - u'mochitest': [u'firefox-50.0a2.en-US.linux-x86_64.common.tests.zip', 07:21:32 INFO - u'firefox-50.0a2.en-US.linux-x86_64.mochitest.tests.zip'], 07:21:32 INFO - u'mozbase': [u'firefox-50.0a2.en-US.linux-x86_64.common.tests.zip'], 07:21:32 INFO - u'reftest': [u'firefox-50.0a2.en-US.linux-x86_64.common.tests.zip', 07:21:32 INFO - u'firefox-50.0a2.en-US.linux-x86_64.reftest.tests.zip'], 07:21:32 INFO - u'talos': [u'firefox-50.0a2.en-US.linux-x86_64.common.tests.zip', 07:21:32 INFO - u'firefox-50.0a2.en-US.linux-x86_64.talos.tests.zip'], 07:21:32 INFO - u'web-platform': [u'firefox-50.0a2.en-US.linux-x86_64.common.tests.zip', 07:21:32 INFO - u'firefox-50.0a2.en-US.linux-x86_64.web-platform.tests.zip'], 07:21:32 INFO - u'xpcshell': [u'firefox-50.0a2.en-US.linux-x86_64.common.tests.zip', 07:21:32 INFO - u'firefox-50.0a2.en-US.linux-x86_64.xpcshell.tests.zip']} 07:21:32 INFO - Downloading packages: [u'firefox-50.0a2.en-US.linux-x86_64.common.tests.zip'] for test suite category: common 07:21:32 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')]} 07:21:32 INFO - https://queue.taskcluster.net/v1/task/dEe2JI-8Qv2bXOdj8oNC1w/artifacts/public/build/firefox-50.0a2.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 07:21:32 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/dEe2JI-8Qv2bXOdj8oNC1w/artifacts/public/build/firefox-50.0a2.en-US.linux-x86_64.common.tests.zip 07:21:32 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/dEe2JI-8Qv2bXOdj8oNC1w/artifacts/public/build/firefox-50.0a2.en-US.linux-x86_64.common.tests.zip 07:21:32 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/dEe2JI-8Qv2bXOdj8oNC1w/artifacts/public/build/firefox-50.0a2.en-US.linux-x86_64.common.tests.zip to /builds/slave/test/build/firefox-50.0a2.en-US.linux-x86_64.common.tests.zip 07:21:32 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/dEe2JI-8Qv2bXOdj8oNC1w/artifacts/public/build/firefox-50.0a2.en-US.linux-x86_64.common.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-50.0a2.en-US.linux-x86_64.common.tests.zip'}, attempt #1 07:21:32 WARNING - Server returned status 404 HTTP Error 404: Not Found for http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/dEe2JI-8Qv2bXOdj8oNC1w/artifacts/public/build/firefox-50.0a2.en-US.linux-x86_64.common.tests.zip 07:21:32 INFO - retry: attempt #1 caught exception: HTTP Error 404: Not Found 07:21:32 INFO - retry: Failed, sleeping 30 seconds before retrying 07:22:02 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/dEe2JI-8Qv2bXOdj8oNC1w/artifacts/public/build/firefox-50.0a2.en-US.linux-x86_64.common.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-50.0a2.en-US.linux-x86_64.common.tests.zip'}, attempt #2 07:22:02 WARNING - Server returned status 404 HTTP Error 404: Not Found for http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/dEe2JI-8Qv2bXOdj8oNC1w/artifacts/public/build/firefox-50.0a2.en-US.linux-x86_64.common.tests.zip 07:22:02 INFO - retry: attempt #2 caught exception: HTTP Error 404: Not Found 07:22:02 INFO - retry: Failed, sleeping 60 seconds before retrying 07:23:02 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/dEe2JI-8Qv2bXOdj8oNC1w/artifacts/public/build/firefox-50.0a2.en-US.linux-x86_64.common.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-50.0a2.en-US.linux-x86_64.common.tests.zip'}, attempt #3 07:23:02 WARNING - Server returned status 404 HTTP Error 404: Not Found for http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/dEe2JI-8Qv2bXOdj8oNC1w/artifacts/public/build/firefox-50.0a2.en-US.linux-x86_64.common.tests.zip 07:23:02 INFO - retry: attempt #3 caught exception: HTTP Error 404: Not Found 07:23:02 INFO - Can't download from http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/dEe2JI-8Qv2bXOdj8oNC1w/artifacts/public/build/firefox-50.0a2.en-US.linux-x86_64.common.tests.zip to /builds/slave/test/build/firefox-50.0a2.en-US.linux-x86_64.common.tests.zip! 07:23:02 INFO - Caught exception: HTTP Error 404: Not Found 07:23:02 INFO - Caught exception: HTTP Error 404: Not Found 07:23:02 INFO - Caught exception: HTTP Error 404: Not Found 07:23:02 INFO - trying https://queue.taskcluster.net/v1/task/dEe2JI-8Qv2bXOdj8oNC1w/artifacts/public/build/firefox-50.0a2.en-US.linux-x86_64.common.tests.zip 07:23:02 INFO - Downloading https://queue.taskcluster.net/v1/task/dEe2JI-8Qv2bXOdj8oNC1w/artifacts/public/build/firefox-50.0a2.en-US.linux-x86_64.common.tests.zip to /builds/slave/test/build/firefox-50.0a2.en-US.linux-x86_64.common.tests.zip 07:23:02 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/dEe2JI-8Qv2bXOdj8oNC1w/artifacts/public/build/firefox-50.0a2.en-US.linux-x86_64.common.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-50.0a2.en-US.linux-x86_64.common.tests.zip'}, attempt #1 07:23:03 INFO - Downloaded 21771059 bytes. 07:23:03 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-50.0a2.en-US.linux-x86_64.common.tests.zip', '-d', '/builds/slave/test/build/tests'] 07:23:03 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-50.0a2.en-US.linux-x86_64.common.tests.zip -d /builds/slave/test/build/tests 07:23:04 INFO - Return code: 0 07:23:04 INFO - Downloading packages: [u'firefox-50.0a2.en-US.linux-x86_64.common.tests.zip', u'firefox-50.0a2.en-US.linux-x86_64.talos.tests.zip'] for test suite category: talos 07:23:04 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')]} 07:23:04 INFO - https://queue.taskcluster.net/v1/task/dEe2JI-8Qv2bXOdj8oNC1w/artifacts/public/build/firefox-50.0a2.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 07:23:04 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/dEe2JI-8Qv2bXOdj8oNC1w/artifacts/public/build/firefox-50.0a2.en-US.linux-x86_64.common.tests.zip 07:23:04 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/dEe2JI-8Qv2bXOdj8oNC1w/artifacts/public/build/firefox-50.0a2.en-US.linux-x86_64.common.tests.zip 07:23:04 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/dEe2JI-8Qv2bXOdj8oNC1w/artifacts/public/build/firefox-50.0a2.en-US.linux-x86_64.common.tests.zip to /builds/slave/test/build/firefox-50.0a2.en-US.linux-x86_64.common.tests.zip 07:23:04 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/dEe2JI-8Qv2bXOdj8oNC1w/artifacts/public/build/firefox-50.0a2.en-US.linux-x86_64.common.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-50.0a2.en-US.linux-x86_64.common.tests.zip'}, attempt #1 07:23:04 WARNING - Server returned status 404 HTTP Error 404: Not Found for http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/dEe2JI-8Qv2bXOdj8oNC1w/artifacts/public/build/firefox-50.0a2.en-US.linux-x86_64.common.tests.zip 07:23:04 INFO - retry: attempt #1 caught exception: HTTP Error 404: Not Found 07:23:04 INFO - retry: Failed, sleeping 30 seconds before retrying 07:23:34 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/dEe2JI-8Qv2bXOdj8oNC1w/artifacts/public/build/firefox-50.0a2.en-US.linux-x86_64.common.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-50.0a2.en-US.linux-x86_64.common.tests.zip'}, attempt #2 07:23:34 WARNING - Server returned status 404 HTTP Error 404: Not Found for http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/dEe2JI-8Qv2bXOdj8oNC1w/artifacts/public/build/firefox-50.0a2.en-US.linux-x86_64.common.tests.zip 07:23:34 INFO - retry: attempt #2 caught exception: HTTP Error 404: Not Found 07:23:34 INFO - retry: Failed, sleeping 60 seconds before retrying 07:24:34 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/dEe2JI-8Qv2bXOdj8oNC1w/artifacts/public/build/firefox-50.0a2.en-US.linux-x86_64.common.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-50.0a2.en-US.linux-x86_64.common.tests.zip'}, attempt #3 07:24:34 WARNING - Server returned status 404 HTTP Error 404: Not Found for http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/dEe2JI-8Qv2bXOdj8oNC1w/artifacts/public/build/firefox-50.0a2.en-US.linux-x86_64.common.tests.zip 07:24:34 INFO - retry: attempt #3 caught exception: HTTP Error 404: Not Found 07:24:34 INFO - Can't download from http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/dEe2JI-8Qv2bXOdj8oNC1w/artifacts/public/build/firefox-50.0a2.en-US.linux-x86_64.common.tests.zip to /builds/slave/test/build/firefox-50.0a2.en-US.linux-x86_64.common.tests.zip! 07:24:34 INFO - Caught exception: HTTP Error 404: Not Found 07:24:34 INFO - Caught exception: HTTP Error 404: Not Found 07:24:34 INFO - Caught exception: HTTP Error 404: Not Found 07:24:34 INFO - trying https://queue.taskcluster.net/v1/task/dEe2JI-8Qv2bXOdj8oNC1w/artifacts/public/build/firefox-50.0a2.en-US.linux-x86_64.common.tests.zip 07:24:34 INFO - Downloading https://queue.taskcluster.net/v1/task/dEe2JI-8Qv2bXOdj8oNC1w/artifacts/public/build/firefox-50.0a2.en-US.linux-x86_64.common.tests.zip to /builds/slave/test/build/firefox-50.0a2.en-US.linux-x86_64.common.tests.zip 07:24:34 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/dEe2JI-8Qv2bXOdj8oNC1w/artifacts/public/build/firefox-50.0a2.en-US.linux-x86_64.common.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-50.0a2.en-US.linux-x86_64.common.tests.zip'}, attempt #1 07:24:35 INFO - Downloaded 21771059 bytes. 07:24:35 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-50.0a2.en-US.linux-x86_64.common.tests.zip', '-d', '/builds/slave/test/build/tests'] 07:24:35 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-50.0a2.en-US.linux-x86_64.common.tests.zip -d /builds/slave/test/build/tests 07:24:36 INFO - Return code: 0 07:24:36 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')]} 07:24:36 INFO - https://queue.taskcluster.net/v1/task/dEe2JI-8Qv2bXOdj8oNC1w/artifacts/public/build/firefox-50.0a2.en-US.linux-x86_64.talos.tests.zip matches https://queue.taskcluster.net 07:24:36 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/dEe2JI-8Qv2bXOdj8oNC1w/artifacts/public/build/firefox-50.0a2.en-US.linux-x86_64.talos.tests.zip 07:24:36 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/dEe2JI-8Qv2bXOdj8oNC1w/artifacts/public/build/firefox-50.0a2.en-US.linux-x86_64.talos.tests.zip 07:24:36 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/dEe2JI-8Qv2bXOdj8oNC1w/artifacts/public/build/firefox-50.0a2.en-US.linux-x86_64.talos.tests.zip to /builds/slave/test/build/firefox-50.0a2.en-US.linux-x86_64.talos.tests.zip 07:24:36 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/dEe2JI-8Qv2bXOdj8oNC1w/artifacts/public/build/firefox-50.0a2.en-US.linux-x86_64.talos.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-50.0a2.en-US.linux-x86_64.talos.tests.zip'}, attempt #1 07:24:36 WARNING - Server returned status 404 HTTP Error 404: Not Found for http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/dEe2JI-8Qv2bXOdj8oNC1w/artifacts/public/build/firefox-50.0a2.en-US.linux-x86_64.talos.tests.zip 07:24:36 INFO - retry: attempt #1 caught exception: HTTP Error 404: Not Found 07:24:36 INFO - retry: Failed, sleeping 30 seconds before retrying 07:25:06 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/dEe2JI-8Qv2bXOdj8oNC1w/artifacts/public/build/firefox-50.0a2.en-US.linux-x86_64.talos.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-50.0a2.en-US.linux-x86_64.talos.tests.zip'}, attempt #2 07:25:06 WARNING - Server returned status 404 HTTP Error 404: Not Found for http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/dEe2JI-8Qv2bXOdj8oNC1w/artifacts/public/build/firefox-50.0a2.en-US.linux-x86_64.talos.tests.zip 07:25:06 INFO - retry: attempt #2 caught exception: HTTP Error 404: Not Found 07:25:06 INFO - retry: Failed, sleeping 60 seconds before retrying 07:26:06 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/dEe2JI-8Qv2bXOdj8oNC1w/artifacts/public/build/firefox-50.0a2.en-US.linux-x86_64.talos.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-50.0a2.en-US.linux-x86_64.talos.tests.zip'}, attempt #3 07:26:06 WARNING - Server returned status 404 HTTP Error 404: Not Found for http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/dEe2JI-8Qv2bXOdj8oNC1w/artifacts/public/build/firefox-50.0a2.en-US.linux-x86_64.talos.tests.zip 07:26:06 INFO - retry: attempt #3 caught exception: HTTP Error 404: Not Found 07:26:06 INFO - Can't download from http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/dEe2JI-8Qv2bXOdj8oNC1w/artifacts/public/build/firefox-50.0a2.en-US.linux-x86_64.talos.tests.zip to /builds/slave/test/build/firefox-50.0a2.en-US.linux-x86_64.talos.tests.zip! 07:26:06 INFO - Caught exception: HTTP Error 404: Not Found 07:26:06 INFO - Caught exception: HTTP Error 404: Not Found 07:26:06 INFO - Caught exception: HTTP Error 404: Not Found 07:26:06 INFO - trying https://queue.taskcluster.net/v1/task/dEe2JI-8Qv2bXOdj8oNC1w/artifacts/public/build/firefox-50.0a2.en-US.linux-x86_64.talos.tests.zip 07:26:06 INFO - Downloading https://queue.taskcluster.net/v1/task/dEe2JI-8Qv2bXOdj8oNC1w/artifacts/public/build/firefox-50.0a2.en-US.linux-x86_64.talos.tests.zip to /builds/slave/test/build/firefox-50.0a2.en-US.linux-x86_64.talos.tests.zip 07:26:06 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/dEe2JI-8Qv2bXOdj8oNC1w/artifacts/public/build/firefox-50.0a2.en-US.linux-x86_64.talos.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-50.0a2.en-US.linux-x86_64.talos.tests.zip'}, attempt #1 07:26:07 INFO - Downloaded 14413740 bytes. 07:26:07 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-50.0a2.en-US.linux-x86_64.talos.tests.zip', '-d', '/builds/slave/test/build/tests'] 07:26:07 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-50.0a2.en-US.linux-x86_64.talos.tests.zip -d /builds/slave/test/build/tests 07:26:07 INFO - Return code: 0 07:26:07 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')]} 07:26:07 INFO - https://queue.taskcluster.net/v1/task/dEe2JI-8Qv2bXOdj8oNC1w/artifacts/public/build/firefox-50.0a2.en-US.linux-x86_64.tar.bz2 matches https://queue.taskcluster.net 07:26:07 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/dEe2JI-8Qv2bXOdj8oNC1w/artifacts/public/build/firefox-50.0a2.en-US.linux-x86_64.tar.bz2 07:26:07 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/dEe2JI-8Qv2bXOdj8oNC1w/artifacts/public/build/firefox-50.0a2.en-US.linux-x86_64.tar.bz2 07:26:07 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/dEe2JI-8Qv2bXOdj8oNC1w/artifacts/public/build/firefox-50.0a2.en-US.linux-x86_64.tar.bz2 to /builds/slave/test/build/firefox-50.0a2.en-US.linux-x86_64.tar.bz2 07:26:07 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/dEe2JI-8Qv2bXOdj8oNC1w/artifacts/public/build/firefox-50.0a2.en-US.linux-x86_64.tar.bz2', 'file_name': '/builds/slave/test/build/firefox-50.0a2.en-US.linux-x86_64.tar.bz2'}, attempt #1 07:26:07 WARNING - Server returned status 404 HTTP Error 404: Not Found for http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/dEe2JI-8Qv2bXOdj8oNC1w/artifacts/public/build/firefox-50.0a2.en-US.linux-x86_64.tar.bz2 07:26:07 INFO - retry: attempt #1 caught exception: HTTP Error 404: Not Found 07:26:07 INFO - retry: Failed, sleeping 30 seconds before retrying 07:26:37 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/dEe2JI-8Qv2bXOdj8oNC1w/artifacts/public/build/firefox-50.0a2.en-US.linux-x86_64.tar.bz2', 'file_name': '/builds/slave/test/build/firefox-50.0a2.en-US.linux-x86_64.tar.bz2'}, attempt #2 07:26:37 WARNING - Server returned status 404 HTTP Error 404: Not Found for http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/dEe2JI-8Qv2bXOdj8oNC1w/artifacts/public/build/firefox-50.0a2.en-US.linux-x86_64.tar.bz2 07:26:37 INFO - retry: attempt #2 caught exception: HTTP Error 404: Not Found 07:26:37 INFO - retry: Failed, sleeping 60 seconds before retrying 07:27:38 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/dEe2JI-8Qv2bXOdj8oNC1w/artifacts/public/build/firefox-50.0a2.en-US.linux-x86_64.tar.bz2', 'file_name': '/builds/slave/test/build/firefox-50.0a2.en-US.linux-x86_64.tar.bz2'}, attempt #3 07:27:38 WARNING - Server returned status 404 HTTP Error 404: Not Found for http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/dEe2JI-8Qv2bXOdj8oNC1w/artifacts/public/build/firefox-50.0a2.en-US.linux-x86_64.tar.bz2 07:27:38 INFO - retry: attempt #3 caught exception: HTTP Error 404: Not Found 07:27:38 INFO - Can't download from http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/dEe2JI-8Qv2bXOdj8oNC1w/artifacts/public/build/firefox-50.0a2.en-US.linux-x86_64.tar.bz2 to /builds/slave/test/build/firefox-50.0a2.en-US.linux-x86_64.tar.bz2! 07:27:38 INFO - Caught exception: HTTP Error 404: Not Found 07:27:38 INFO - Caught exception: HTTP Error 404: Not Found 07:27:38 INFO - Caught exception: HTTP Error 404: Not Found 07:27:38 INFO - trying https://queue.taskcluster.net/v1/task/dEe2JI-8Qv2bXOdj8oNC1w/artifacts/public/build/firefox-50.0a2.en-US.linux-x86_64.tar.bz2 07:27:38 INFO - Downloading https://queue.taskcluster.net/v1/task/dEe2JI-8Qv2bXOdj8oNC1w/artifacts/public/build/firefox-50.0a2.en-US.linux-x86_64.tar.bz2 to /builds/slave/test/build/firefox-50.0a2.en-US.linux-x86_64.tar.bz2 07:27:38 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/dEe2JI-8Qv2bXOdj8oNC1w/artifacts/public/build/firefox-50.0a2.en-US.linux-x86_64.tar.bz2', 'file_name': '/builds/slave/test/build/firefox-50.0a2.en-US.linux-x86_64.tar.bz2'}, attempt #1 07:27:39 INFO - Downloaded 63891050 bytes. 07:27:39 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/dEe2JI-8Qv2bXOdj8oNC1w/artifacts/public/build/firefox-50.0a2.en-US.linux-x86_64.tar.bz2 07:27:39 INFO - mkdir: /builds/slave/test/properties 07:27:39 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 07:27:39 INFO - Writing to file /builds/slave/test/properties/build_url 07:27:39 INFO - Contents: 07:27:39 INFO - build_url:https://queue.taskcluster.net/v1/task/dEe2JI-8Qv2bXOdj8oNC1w/artifacts/public/build/firefox-50.0a2.en-US.linux-x86_64.tar.bz2 07:27:39 INFO - Running post-action listener: _resource_record_post_action 07:27:39 INFO - Running post-action listener: set_extra_try_arguments 07:27:39 INFO - [mozharness: 2016-09-17 14:27:39.900054Z] Finished download-and-extract step (success) 07:27:39 INFO - [mozharness: 2016-09-17 14:27:39.900285Z] Running populate-webroot step. 07:27:39 INFO - Running pre-action listener: _resource_record_pre_action 07:27:39 INFO - Running main action method: populate_webroot 07:27:39 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 07:27:39 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 07:27:39 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 07:27:39 INFO - '--tppagecycles', 07:27:39 INFO - '7'], 07:27:39 INFO - 'tests': ['tsvgm']}}, 07:27:39 INFO - 'suites': {'chromez': {'talos_options': ['--disable-e10s'], 07:27:39 INFO - 'tests': ['tresize', 'tcanvasmark']}, 07:27:39 INFO - 'chromez-e10s': {'tests': ['tresize', 'tcanvasmark']}, 07:27:39 INFO - 'dromaeojs': {'talos_options': ['--disable-e10s'], 07:27:39 INFO - 'tests': ['dromaeo_css', 'kraken']}, 07:27:39 INFO - 'dromaeojs-e10s': {'tests': ['dromaeo_css', 'kraken']}, 07:27:39 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 07:27:39 INFO - 'talos_options': ['--disable-e10s'], 07:27:39 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 07:27:39 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 07:27:39 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 07:27:39 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 07:27:39 INFO - 'talos_options': ['--disable-e10s'], 07:27:39 INFO - 'tests': ['damp', 'tps']}, 07:27:39 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 07:27:39 INFO - 'tests': ['damp', 'tps']}, 07:27:39 INFO - 'g3': {'talos_options': ['--disable-e10s'], 07:27:39 INFO - 'tests': ['dromaeo_dom']}, 07:27:39 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 07:27:39 INFO - 'g4': {'talos_options': ['--disable-e10s'], 07:27:39 INFO - 'tests': ['basic_compositor_video']}, 07:27:39 INFO - 'g4-e10s': {'tests': ['basic_compositor_video']}, 07:27:39 INFO - 'other': {'talos_options': ['--disable-e10s'], 07:27:39 INFO - 'tests': ['a11yr', 07:27:39 INFO - 'ts_paint', 07:27:39 INFO - 'tpaint', 07:27:39 INFO - 'sessionrestore', 07:27:39 INFO - 'sessionrestore_no_auto_restore', 07:27:39 INFO - 'tabpaint']}, 07:27:39 INFO - 'other-e10s': {'tests': ['a11yr', 07:27:39 INFO - 'ts_paint', 07:27:39 INFO - 'tpaint', 07:27:39 INFO - 'sessionrestore', 07:27:39 INFO - 'sessionrestore_no_auto_restore', 07:27:39 INFO - 'tabpaint']}, 07:27:39 INFO - 'other-e10s_l64': {'tests': ['a11yr', 07:27:39 INFO - 'ts_paint', 07:27:39 INFO - 'tpaint', 07:27:39 INFO - 'sessionrestore', 07:27:39 INFO - 'sessionrestore_no_auto_restore', 07:27:39 INFO - 'tabpaint']}, 07:27:39 INFO - 'other-e10s_nol64': {'tests': ['a11yr', 07:27:39 INFO - 'ts_paint', 07:27:39 INFO - 'tpaint', 07:27:39 INFO - 'sessionrestore', 07:27:39 INFO - 'sessionrestore_no_auto_restore', 07:27:39 INFO - 'tabpaint']}, 07:27:39 INFO - 'other_l64': {'talos_options': ['--disable-e10s'], 07:27:39 INFO - 'tests': ['a11yr', 07:27:39 INFO - 'ts_paint', 07:27:39 INFO - 'tpaint', 07:27:39 INFO - 'sessionrestore', 07:27:39 INFO - 'sessionrestore_no_auto_restore', 07:27:39 INFO - 'tabpaint']}, 07:27:39 INFO - 'other_nol64': {'talos_options': ['--disable-e10s'], 07:27:39 INFO - 'tests': ['a11yr', 07:27:39 INFO - 'ts_paint', 07:27:39 INFO - 'tpaint', 07:27:39 INFO - 'sessionrestore', 07:27:39 INFO - 'sessionrestore_no_auto_restore', 07:27:39 INFO - 'tabpaint']}, 07:27:39 INFO - 'svgr': {'talos_options': ['--disable-e10s'], 07:27:39 INFO - 'tests': ['tsvgx', 07:27:39 INFO - 'tsvgr_opacity', 07:27:39 INFO - 'tart', 07:27:39 INFO - 'tscrollx', 07:27:39 INFO - 'cart']}, 07:27:39 INFO - 'svgr-e10s': {'tests': ['tsvgx', 07:27:39 INFO - 'tsvgr_opacity', 07:27:39 INFO - 'tart', 07:27:39 INFO - 'tscrollx', 07:27:39 INFO - 'cart']}, 07:27:39 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 07:27:39 INFO - 'talos_options': ['--disable-e10s'], 07:27:39 INFO - 'tests': ['tp5o']}, 07:27:39 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 07:27:39 INFO - 'tests': ['tp5o']}, 07:27:39 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 07:27:39 INFO - 'talos_options': ['--disable-e10s', 07:27:39 INFO - '--xperf_path', 07:27:39 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 07:27:39 INFO - 'tests': ['tp5n']}, 07:27:39 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 07:27:39 INFO - 'talos_options': ['--xperf_path', 07:27:39 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 07:27:39 INFO - 'tests': ['tp5n']}}, 07:27:39 INFO - 'talos.zip': {'path': '', 07:27:39 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 07:27:39 INFO - Running post-action listener: _resource_record_post_action 07:27:39 INFO - [mozharness: 2016-09-17 14:27:39.921869Z] Finished populate-webroot step (success) 07:27:39 INFO - [mozharness: 2016-09-17 14:27:39.921958Z] Running create-virtualenv step. 07:27:39 INFO - Running pre-action listener: _resource_record_pre_action 07:27:39 INFO - Running main action method: create_virtualenv 07:27:39 INFO - Creating virtualenv /builds/slave/test/build/venv 07:27:39 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 07:27:39 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 07:27:40 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 07:27:40 INFO - Using real prefix '/usr' 07:27:40 INFO - New python executable in /builds/slave/test/build/venv/bin/python 07:27:40 INFO - Installing distribute.............................................................................................................................................................................................done. 07:27:42 INFO - Installing pip.................done. 07:27:42 INFO - Return code: 0 07:27:42 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 07:27: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')]} 07:27:42 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 07:27:42 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:27: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')]} 07:27:42 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 07:27:42 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:27:42 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'pip>=1.5']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x15ff030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x17628a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x182e400>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x18bd570>, '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 0x18be470>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x18be900>, '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': '5bd038846534b2fdfa68eeae000001e2-1474121999.168975-1245787711', '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 07:27:42 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'pip>=1.5'] in /builds/slave/test/build 07:27:42 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub pip>=1.5 07:27:42 INFO - Using env: {'DISPLAY': ':0', 07:27:42 INFO - 'HOME': '/home/cltbld', 07:27:42 INFO - 'LANG': 'en_US.UTF-8', 07:27:42 INFO - 'LANGUAGE': 'en_US:en', 07:27:42 INFO - 'LOGNAME': 'cltbld', 07:27:42 INFO - 'MAIL': '/var/mail/cltbld', 07:27:42 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 07:27:42 INFO - 'MOZ_NO_REMOTE': '1', 07:27:42 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 07:27:42 INFO - 'NO_EM_RESTART': '1', 07:27:42 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 07:27:42 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 07:27:42 INFO - 'PWD': '/builds/slave/test', 07:27:42 INFO - 'SHELL': '/bin/bash', 07:27:42 INFO - 'SHLVL': '1', 07:27:42 INFO - 'TERM': 'linux', 07:27:42 INFO - 'TMOUT': '86400', 07:27:42 INFO - 'USER': 'cltbld', 07:27:42 INFO - 'XDG_SESSION_COOKIE': '5bd038846534b2fdfa68eeae000001e2-1474121999.168975-1245787711', 07:27:42 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 07:27:42 INFO - '_': '/tools/buildbot/bin/python'} 07:27:42 INFO - Ignoring indexes: https://pypi.python.org/simple/ 07:27:42 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 07:27:42 INFO - Cleaning up... 07:27:42 INFO - Return code: 0 07:27:42 INFO - Installing psutil>=3.1.1 into virtualenv /builds/slave/test/build/venv 07:27: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')]} 07:27:42 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 07:27:42 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:27: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')]} 07:27:42 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 07:27:42 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:27:42 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'psutil>=3.1.1']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x15ff030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x17628a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x182e400>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x18bd570>, '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 0x18be470>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x18be900>, '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': '5bd038846534b2fdfa68eeae000001e2-1474121999.168975-1245787711', '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 07:27:42 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'psutil>=3.1.1'] in /builds/slave/test/build 07:27:42 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub psutil>=3.1.1 07:27:42 INFO - Using env: {'DISPLAY': ':0', 07:27:42 INFO - 'HOME': '/home/cltbld', 07:27:42 INFO - 'LANG': 'en_US.UTF-8', 07:27:42 INFO - 'LANGUAGE': 'en_US:en', 07:27:42 INFO - 'LOGNAME': 'cltbld', 07:27:42 INFO - 'MAIL': '/var/mail/cltbld', 07:27:42 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 07:27:42 INFO - 'MOZ_NO_REMOTE': '1', 07:27:42 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 07:27:42 INFO - 'NO_EM_RESTART': '1', 07:27:42 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 07:27:42 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 07:27:42 INFO - 'PWD': '/builds/slave/test', 07:27:42 INFO - 'SHELL': '/bin/bash', 07:27:42 INFO - 'SHLVL': '1', 07:27:42 INFO - 'TERM': 'linux', 07:27:42 INFO - 'TMOUT': '86400', 07:27:42 INFO - 'USER': 'cltbld', 07:27:42 INFO - 'XDG_SESSION_COOKIE': '5bd038846534b2fdfa68eeae000001e2-1474121999.168975-1245787711', 07:27:42 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 07:27:42 INFO - '_': '/tools/buildbot/bin/python'} 07:27:42 INFO - Ignoring indexes: https://pypi.python.org/simple/ 07:27:42 INFO - Downloading/unpacking psutil>=3.1.1 07:27:42 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 07:27:42 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 07:27:42 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 07:27:42 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 07:27:42 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 07:27:42 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 07:27:44 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 07:27:44 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 07:27:44 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 07:27:44 INFO - Installing collected packages: psutil 07:27:44 INFO - Running setup.py install for psutil 07:27:44 INFO - building 'psutil._psutil_linux' extension 07:27:44 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 07:27:45 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 07:27:45 INFO - building 'psutil._psutil_posix' extension 07:27:45 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 07:27:45 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 07:27:45 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 07:27:45 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 07:27:45 INFO - Successfully installed psutil 07:27:45 INFO - Cleaning up... 07:27:45 INFO - Return code: 0 07:27:45 INFO - Installing mozsystemmonitor==0.3 into virtualenv /builds/slave/test/build/venv 07:27:45 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')]} 07:27:45 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 07:27:45 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:27:45 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')]} 07:27:45 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 07:27:45 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:27:45 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'mozsystemmonitor==0.3']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x15ff030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x17628a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x182e400>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x18bd570>, '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 0x18be470>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x18be900>, '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': '5bd038846534b2fdfa68eeae000001e2-1474121999.168975-1245787711', '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 07:27:45 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'mozsystemmonitor==0.3'] in /builds/slave/test/build 07:27:45 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub mozsystemmonitor==0.3 07:27:45 INFO - Using env: {'DISPLAY': ':0', 07:27:45 INFO - 'HOME': '/home/cltbld', 07:27:45 INFO - 'LANG': 'en_US.UTF-8', 07:27:45 INFO - 'LANGUAGE': 'en_US:en', 07:27:45 INFO - 'LOGNAME': 'cltbld', 07:27:45 INFO - 'MAIL': '/var/mail/cltbld', 07:27:45 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 07:27:45 INFO - 'MOZ_NO_REMOTE': '1', 07:27:45 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 07:27:45 INFO - 'NO_EM_RESTART': '1', 07:27:45 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 07:27:45 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 07:27:45 INFO - 'PWD': '/builds/slave/test', 07:27:45 INFO - 'SHELL': '/bin/bash', 07:27:45 INFO - 'SHLVL': '1', 07:27:45 INFO - 'TERM': 'linux', 07:27:45 INFO - 'TMOUT': '86400', 07:27:45 INFO - 'USER': 'cltbld', 07:27:45 INFO - 'XDG_SESSION_COOKIE': '5bd038846534b2fdfa68eeae000001e2-1474121999.168975-1245787711', 07:27:45 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 07:27:45 INFO - '_': '/tools/buildbot/bin/python'} 07:27:45 INFO - Ignoring indexes: https://pypi.python.org/simple/ 07:27:45 INFO - Downloading/unpacking mozsystemmonitor==0.3 07:27:45 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 07:27:45 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 07:27:45 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 07:27:45 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 07:27:45 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 07:27:45 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 07:27:47 INFO - Downloading mozsystemmonitor-0.3.tar.gz 07:27:47 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 07:27:47 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.3) 07:27:47 INFO - Installing collected packages: mozsystemmonitor 07:27:47 INFO - Running setup.py install for mozsystemmonitor 07:27:47 INFO - Successfully installed mozsystemmonitor 07:27:47 INFO - Cleaning up... 07:27:47 INFO - Return code: 0 07:27:47 INFO - Installing jsonschema==2.5.1 into virtualenv /builds/slave/test/build/venv 07:27:47 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')]} 07:27:47 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 07:27:47 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:27:47 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')]} 07:27:47 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 07:27:47 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:27:47 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema==2.5.1']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x15ff030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x17628a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x182e400>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x18bd570>, '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 0x18be470>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x18be900>, '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': '5bd038846534b2fdfa68eeae000001e2-1474121999.168975-1245787711', '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 07:27:47 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema==2.5.1'] in /builds/slave/test/build 07:27:47 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub jsonschema==2.5.1 07:27:47 INFO - Using env: {'DISPLAY': ':0', 07:27:47 INFO - 'HOME': '/home/cltbld', 07:27:47 INFO - 'LANG': 'en_US.UTF-8', 07:27:47 INFO - 'LANGUAGE': 'en_US:en', 07:27:47 INFO - 'LOGNAME': 'cltbld', 07:27:47 INFO - 'MAIL': '/var/mail/cltbld', 07:27:47 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 07:27:47 INFO - 'MOZ_NO_REMOTE': '1', 07:27:47 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 07:27:47 INFO - 'NO_EM_RESTART': '1', 07:27:47 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 07:27:47 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 07:27:47 INFO - 'PWD': '/builds/slave/test', 07:27:47 INFO - 'SHELL': '/bin/bash', 07:27:47 INFO - 'SHLVL': '1', 07:27:47 INFO - 'TERM': 'linux', 07:27:47 INFO - 'TMOUT': '86400', 07:27:47 INFO - 'USER': 'cltbld', 07:27:47 INFO - 'XDG_SESSION_COOKIE': '5bd038846534b2fdfa68eeae000001e2-1474121999.168975-1245787711', 07:27:47 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 07:27:47 INFO - '_': '/tools/buildbot/bin/python'} 07:27:47 INFO - Ignoring indexes: https://pypi.python.org/simple/ 07:27:47 INFO - Downloading/unpacking jsonschema==2.5.1 07:27:47 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 07:27:47 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 07:27:47 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 07:27:47 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 07:27:47 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 07:27:47 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 07:27:49 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 07:27:49 INFO - Downloading/unpacking functools32 (from jsonschema==2.5.1) 07:27:49 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 07:27:49 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 07:27:49 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 07:27:49 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 07:27:49 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 07:27:49 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 07:27:50 INFO - Downloading functools32-3.2.3-2.tar.gz 07:27:50 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/functools32/setup.py) egg_info for package functools32 07:27:50 INFO - warning: no files found matching '*.txt' 07:27:50 INFO - no previously-included directories found matching 'build' 07:27:50 INFO - no previously-included directories found matching 'dist' 07:27:50 INFO - no previously-included directories found matching '.git*' 07:27:50 INFO - Installing collected packages: jsonschema, functools32 07:27:50 INFO - Running setup.py install for functools32 07:27:50 INFO - warning: no files found matching '*.txt' 07:27:50 INFO - no previously-included directories found matching 'build' 07:27:50 INFO - no previously-included directories found matching 'dist' 07:27:50 INFO - no previously-included directories found matching '.git*' 07:27:50 INFO - Successfully installed jsonschema functools32 07:27:50 INFO - Cleaning up... 07:27:50 INFO - Return code: 0 07:27:50 INFO - Installing functools32==3.2.3-2 into virtualenv /builds/slave/test/build/venv 07:27:50 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')]} 07:27:50 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 07:27:50 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:27:50 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')]} 07:27:50 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 07:27:50 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:27:50 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'functools32==3.2.3-2']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x15ff030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x17628a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x182e400>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x18bd570>, '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 0x18be470>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x18be900>, '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': '5bd038846534b2fdfa68eeae000001e2-1474121999.168975-1245787711', '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 07:27:50 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'functools32==3.2.3-2'] in /builds/slave/test/build 07:27:50 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub functools32==3.2.3-2 07:27:50 INFO - Using env: {'DISPLAY': ':0', 07:27:50 INFO - 'HOME': '/home/cltbld', 07:27:50 INFO - 'LANG': 'en_US.UTF-8', 07:27:50 INFO - 'LANGUAGE': 'en_US:en', 07:27:50 INFO - 'LOGNAME': 'cltbld', 07:27:50 INFO - 'MAIL': '/var/mail/cltbld', 07:27:50 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 07:27:50 INFO - 'MOZ_NO_REMOTE': '1', 07:27:50 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 07:27:50 INFO - 'NO_EM_RESTART': '1', 07:27:50 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 07:27:50 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 07:27:50 INFO - 'PWD': '/builds/slave/test', 07:27:50 INFO - 'SHELL': '/bin/bash', 07:27:50 INFO - 'SHLVL': '1', 07:27:50 INFO - 'TERM': 'linux', 07:27:50 INFO - 'TMOUT': '86400', 07:27:50 INFO - 'USER': 'cltbld', 07:27:50 INFO - 'XDG_SESSION_COOKIE': '5bd038846534b2fdfa68eeae000001e2-1474121999.168975-1245787711', 07:27:50 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 07:27:50 INFO - '_': '/tools/buildbot/bin/python'} 07:27:50 INFO - Ignoring indexes: https://pypi.python.org/simple/ 07:27:50 INFO - Requirement already satisfied (use --upgrade to upgrade): functools32==3.2.3-2 in ./venv/lib/python2.7/site-packages 07:27:50 INFO - Cleaning up... 07:27:50 INFO - Return code: 0 07:27:50 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 07:27:50 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')]} 07:27:50 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 07:27:50 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:27:50 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')]} 07:27:50 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 07:27:50 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:27:50 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'blobuploader==1.2.4']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x15ff030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x17628a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x182e400>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x18bd570>, '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 0x18be470>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x18be900>, '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': '5bd038846534b2fdfa68eeae000001e2-1474121999.168975-1245787711', '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 07:27:50 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'blobuploader==1.2.4'] in /builds/slave/test/build 07:27:50 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub blobuploader==1.2.4 07:27:50 INFO - Using env: {'DISPLAY': ':0', 07:27:50 INFO - 'HOME': '/home/cltbld', 07:27:50 INFO - 'LANG': 'en_US.UTF-8', 07:27:50 INFO - 'LANGUAGE': 'en_US:en', 07:27:50 INFO - 'LOGNAME': 'cltbld', 07:27:50 INFO - 'MAIL': '/var/mail/cltbld', 07:27:50 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 07:27:50 INFO - 'MOZ_NO_REMOTE': '1', 07:27:50 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 07:27:50 INFO - 'NO_EM_RESTART': '1', 07:27:50 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 07:27:50 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 07:27:50 INFO - 'PWD': '/builds/slave/test', 07:27:50 INFO - 'SHELL': '/bin/bash', 07:27:50 INFO - 'SHLVL': '1', 07:27:50 INFO - 'TERM': 'linux', 07:27:50 INFO - 'TMOUT': '86400', 07:27:50 INFO - 'USER': 'cltbld', 07:27:50 INFO - 'XDG_SESSION_COOKIE': '5bd038846534b2fdfa68eeae000001e2-1474121999.168975-1245787711', 07:27:50 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 07:27:50 INFO - '_': '/tools/buildbot/bin/python'} 07:27:50 INFO - Ignoring indexes: https://pypi.python.org/simple/ 07:27:50 INFO - Downloading/unpacking blobuploader==1.2.4 07:27:50 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 07:27:50 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 07:27:50 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 07:27:50 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 07:27:50 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 07:27:50 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 07:27:52 INFO - Downloading blobuploader-1.2.4.tar.gz 07:27:52 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 07:27:52 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 07:27:52 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 07:27:52 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 07:27:52 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 07:27:52 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 07:27:52 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 07:27:52 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 07:27:52 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 07:27:53 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 07:27:53 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 07:27:53 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 07:27:53 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 07:27:53 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 07:27:53 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 07:27:53 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 07:27:53 INFO - Downloading docopt-0.6.1.tar.gz 07:27:53 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 07:27:53 INFO - Installing collected packages: blobuploader, requests, docopt 07:27:53 INFO - Running setup.py install for blobuploader 07:27:53 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 07:27:53 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 07:27:53 INFO - Running setup.py install for requests 07:27:53 INFO - Running setup.py install for docopt 07:27:53 INFO - Successfully installed blobuploader requests docopt 07:27:53 INFO - Cleaning up... 07:27:54 INFO - Return code: 0 07:27:54 INFO - Installing None into virtualenv /builds/slave/test/build/venv 07:27: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')]} 07:27:54 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 07:27:54 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:27: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')]} 07:27:54 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 07:27:54 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:27:54 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--no-deps', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x15ff030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x17628a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x182e400>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x18bd570>, '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 0x18be470>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x18be900>, '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': '5bd038846534b2fdfa68eeae000001e2-1474121999.168975-1245787711', '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 07:27:54 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--no-deps', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test/build/tests/config 07:27:54 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --no-deps --timeout 120 -r /builds/slave/test/build/tests/config/mozbase_requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 07:27:54 INFO - Using env: {'DISPLAY': ':0', 07:27:54 INFO - 'HOME': '/home/cltbld', 07:27:54 INFO - 'LANG': 'en_US.UTF-8', 07:27:54 INFO - 'LANGUAGE': 'en_US:en', 07:27:54 INFO - 'LOGNAME': 'cltbld', 07:27:54 INFO - 'MAIL': '/var/mail/cltbld', 07:27:54 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 07:27:54 INFO - 'MOZ_NO_REMOTE': '1', 07:27:54 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 07:27:54 INFO - 'NO_EM_RESTART': '1', 07:27:54 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 07:27:54 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 07:27:54 INFO - 'PWD': '/builds/slave/test', 07:27:54 INFO - 'SHELL': '/bin/bash', 07:27:54 INFO - 'SHLVL': '1', 07:27:54 INFO - 'TERM': 'linux', 07:27:54 INFO - 'TMOUT': '86400', 07:27:54 INFO - 'USER': 'cltbld', 07:27:54 INFO - 'XDG_SESSION_COOKIE': '5bd038846534b2fdfa68eeae000001e2-1474121999.168975-1245787711', 07:27:54 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 07:27:54 INFO - '_': '/tools/buildbot/bin/python'} 07:27:54 INFO - Ignoring indexes: https://pypi.python.org/simple/ 07:27:54 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 07:27:54 INFO - Running setup.py (path:/tmp/pip-Qpw4w9-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 07:27:54 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 07:27:54 INFO - Running setup.py (path:/tmp/pip-ciyWfD-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 07:27:54 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 07:27:54 INFO - Running setup.py (path:/tmp/pip-6a5pDe-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 07:27:54 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 07:27:54 INFO - Running setup.py (path:/tmp/pip-82XpdH-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 07:27:54 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 07:27:54 INFO - Running setup.py (path:/tmp/pip-6UbLZ3-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 07:27:54 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 07:27:54 INFO - Running setup.py (path:/tmp/pip-AFQB3g-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 07:27:54 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 07:27:54 INFO - Running setup.py (path:/tmp/pip-oDBjLT-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 07:27:54 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 07:27:54 INFO - Running setup.py (path:/tmp/pip-fVHdnr-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 07:27:54 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 07:27:54 INFO - Running setup.py (path:/tmp/pip-Wgk2VE-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 07:27:54 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 07:27:54 INFO - Running setup.py (path:/tmp/pip-OWXoTZ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 07:27:54 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 07:27:54 INFO - Running setup.py (path:/tmp/pip-HI7y6c-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 07:27:55 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 07:27:55 INFO - Running setup.py (path:/tmp/pip-AArs3t-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 07:27:55 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 07:27:55 INFO - Running setup.py (path:/tmp/pip-CFfEt3-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 07:27:55 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 07:27:55 INFO - Running setup.py (path:/tmp/pip-X52NAR-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 07:27:55 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 07:27:55 INFO - Running setup.py (path:/tmp/pip-caZF8g-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 07:27:55 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 07:27:55 INFO - Running setup.py (path:/tmp/pip-UIkTnp-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 07:27:55 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 07:27:55 INFO - Running setup.py (path:/tmp/pip-DQCWVx-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 07:27:55 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 07:27:55 INFO - Running setup.py install for manifestparser 07:27:55 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 07:27:55 INFO - Running setup.py install for mozcrash 07:27:55 INFO - Running setup.py install for mozdebug 07:27:55 INFO - Running setup.py install for mozdevice 07:27:55 INFO - Installing sutini script to /builds/slave/test/build/venv/bin 07:27:55 INFO - Installing dm script to /builds/slave/test/build/venv/bin 07:27:55 INFO - Running setup.py install for mozfile 07:27:55 INFO - Running setup.py install for mozhttpd 07:27:56 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 07:27:56 INFO - Running setup.py install for mozinfo 07:27:56 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 07:27:56 INFO - Running setup.py install for mozInstall 07:27:56 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 07:27:56 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 07:27:56 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 07:27:56 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 07:27:56 INFO - Running setup.py install for mozleak 07:27:56 INFO - Running setup.py install for mozlog 07:27:56 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 07:27:56 INFO - Running setup.py install for moznetwork 07:27:56 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 07:27:56 INFO - Running setup.py install for mozprocess 07:27:56 INFO - Running setup.py install for mozprofile 07:27:56 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 07:27:56 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 07:27:56 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 07:27:56 INFO - Running setup.py install for mozrunner 07:27:56 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 07:27:56 INFO - Running setup.py install for mozscreenshot 07:27:57 INFO - Running setup.py install for moztest 07:27:57 INFO - Running setup.py install for mozversion 07:27:57 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 07:27:57 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 07:27:57 INFO - Cleaning up... 07:27:57 INFO - Return code: 0 07:27:57 INFO - Installing None into virtualenv /builds/slave/test/build/venv 07:27: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')]} 07:27:57 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 07:27:57 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:27: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')]} 07:27:57 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 07:27:57 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:27:57 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x15ff030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x17628a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x182e400>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x18bd570>, '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 0x18be470>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x18be900>, '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': '5bd038846534b2fdfa68eeae000001e2-1474121999.168975-1245787711', '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 07:27:57 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test/build/tests/config 07:27:57 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 -r /builds/slave/test/build/tests/config/mozbase_requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 07:27:57 INFO - Using env: {'DISPLAY': ':0', 07:27:57 INFO - 'HOME': '/home/cltbld', 07:27:57 INFO - 'LANG': 'en_US.UTF-8', 07:27:57 INFO - 'LANGUAGE': 'en_US:en', 07:27:57 INFO - 'LOGNAME': 'cltbld', 07:27:57 INFO - 'MAIL': '/var/mail/cltbld', 07:27:57 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 07:27:57 INFO - 'MOZ_NO_REMOTE': '1', 07:27:57 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 07:27:57 INFO - 'NO_EM_RESTART': '1', 07:27:57 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 07:27:57 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 07:27:57 INFO - 'PWD': '/builds/slave/test', 07:27:57 INFO - 'SHELL': '/bin/bash', 07:27:57 INFO - 'SHLVL': '1', 07:27:57 INFO - 'TERM': 'linux', 07:27:57 INFO - 'TMOUT': '86400', 07:27:57 INFO - 'USER': 'cltbld', 07:27:57 INFO - 'XDG_SESSION_COOKIE': '5bd038846534b2fdfa68eeae000001e2-1474121999.168975-1245787711', 07:27:57 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 07:27:57 INFO - '_': '/tools/buildbot/bin/python'} 07:27:57 INFO - Ignoring indexes: https://pypi.python.org/simple/ 07:27:57 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 07:27:57 INFO - Running setup.py (path:/tmp/pip-ReCfsC-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 07:27:57 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)) 07:27:57 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 07:27:57 INFO - Running setup.py (path:/tmp/pip-bx3VDa-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 07:27:57 INFO - Requirement already satisfied (use --upgrade to upgrade): mozcrash==0.17 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)) 07:27:57 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 07:27:57 INFO - Running setup.py (path:/tmp/pip-oMogf8-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 07:27:57 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)) 07:27:57 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 07:27:57 INFO - Running setup.py (path:/tmp/pip-0FRl3g-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 07:27:57 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)) 07:27:57 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 07:27:57 INFO - Running setup.py (path:/tmp/pip-KTgw5M-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 07:27:57 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)) 07:27:57 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 07:27:57 INFO - Running setup.py (path:/tmp/pip-7tk6Bt-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 07:27:57 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)) 07:27:57 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 07:27:57 INFO - Running setup.py (path:/tmp/pip-lJCuMD-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 07:27:57 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)) 07:27:57 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 07:27:57 INFO - Running setup.py (path:/tmp/pip-ikF9fd-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 07:27:58 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)) 07:27:58 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 07:27:58 INFO - Running setup.py (path:/tmp/pip-YBOZAu-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 07:27:58 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)) 07:27:58 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 07:27:58 INFO - Running setup.py (path:/tmp/pip-TOHe2t-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 07:27:58 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog==3.3 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)) 07:27:58 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 07:27:58 INFO - Running setup.py (path:/tmp/pip-BJK74h-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 07:27:58 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)) 07:27:58 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 07:27:58 INFO - Running setup.py (path:/tmp/pip-eD06RC-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 07:27:58 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess==0.23 from file:///builds/slave/test/build/tests/mozbase/mozprocess in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 12)) 07:27:58 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 07:27:58 INFO - Running setup.py (path:/tmp/pip-R6TKTa-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 07:27:58 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)) 07:27:58 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 07:27:58 INFO - Running setup.py (path:/tmp/pip-OvFE7S-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 07:27:58 INFO - Requirement already satisfied (use --upgrade to upgrade): mozrunner==6.12 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)) 07:27:58 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 07:27:58 INFO - Running setup.py (path:/tmp/pip-2orqfF-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 07:27:58 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)) 07:27:58 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 07:27:58 INFO - Running setup.py (path:/tmp/pip-aama3R-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 07:27:58 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)) 07:27:58 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 07:27:58 INFO - Running setup.py (path:/tmp/pip-R4EZ0H-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 07:27:58 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)) 07:27:58 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.17->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 07:27:58 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.17->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 07:27:58 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)) 07:27:58 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)) 07:27:58 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)) 07:27:58 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.3->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 07:27:58 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 07:27:58 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 07:27:58 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 07:27:58 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 07:27:58 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 07:27:58 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 07:28:00 INFO - Downloading blessings-1.6.tar.gz 07:28:00 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 07:28:00 INFO - Installing collected packages: blessings 07:28:00 INFO - Running setup.py install for blessings 07:28:00 INFO - Successfully installed blessings 07:28:00 INFO - Cleaning up... 07:28:00 INFO - Return code: 0 07:28:00 INFO - Done creating virtualenv /builds/slave/test/build/venv. 07:28:00 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 07:28:00 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 07:28:01 INFO - Reading from file tmpfile_stdout 07:28:01 INFO - Current package versions: 07:28:01 INFO - argparse == 1.2.1 07:28:01 INFO - blessings == 1.6 07:28:01 INFO - blobuploader == 1.2.4 07:28:01 INFO - docopt == 0.6.1 07:28:01 INFO - functools32 == 3.2.3-2 07:28:01 INFO - jsonschema == 2.5.1 07:28:01 INFO - manifestparser == 1.1 07:28:01 INFO - mozInstall == 1.12 07:28:01 INFO - mozcrash == 0.17 07:28:01 INFO - mozdebug == 0.1 07:28:01 INFO - mozdevice == 0.48 07:28:01 INFO - mozfile == 1.2 07:28:01 INFO - mozhttpd == 0.7 07:28:01 INFO - mozinfo == 0.9 07:28:01 INFO - mozleak == 0.1 07:28:01 INFO - mozlog == 3.3 07:28:01 INFO - moznetwork == 0.27 07:28:01 INFO - mozprocess == 0.23 07:28:01 INFO - mozprofile == 0.28 07:28:01 INFO - mozrunner == 6.12 07:28:01 INFO - mozscreenshot == 0.1 07:28:01 INFO - mozsystemmonitor == 0.3 07:28:01 INFO - moztest == 0.7 07:28:01 INFO - mozversion == 1.4 07:28:01 INFO - psutil == 3.1.1 07:28:01 INFO - requests == 1.2.3 07:28:01 INFO - wsgiref == 0.1.2 07:28:01 INFO - Installing None into virtualenv /builds/slave/test/build/venv 07:28:01 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')]} 07:28:01 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 07:28:01 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:28:01 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')]} 07:28:01 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 07:28:01 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:28:01 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test/build/tests/talos/requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x15ff030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x17628a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x182e400>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x18bd570>, '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 0x18be470>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x18be900>, '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': '5bd038846534b2fdfa68eeae000001e2-1474121999.168975-1245787711', '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 07:28:01 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test/build/tests/talos/requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test/build/tests/talos 07:28:01 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 -r /builds/slave/test/build/tests/talos/requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 07:28:01 INFO - Using env: {'DISPLAY': ':0', 07:28:01 INFO - 'HOME': '/home/cltbld', 07:28:01 INFO - 'LANG': 'en_US.UTF-8', 07:28:01 INFO - 'LANGUAGE': 'en_US:en', 07:28:01 INFO - 'LOGNAME': 'cltbld', 07:28:01 INFO - 'MAIL': '/var/mail/cltbld', 07:28:01 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 07:28:01 INFO - 'MOZ_NO_REMOTE': '1', 07:28:01 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 07:28:01 INFO - 'NO_EM_RESTART': '1', 07:28:01 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 07:28:01 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 07:28:01 INFO - 'PWD': '/builds/slave/test', 07:28:01 INFO - 'SHELL': '/bin/bash', 07:28:01 INFO - 'SHLVL': '1', 07:28:01 INFO - 'TERM': 'linux', 07:28:01 INFO - 'TMOUT': '86400', 07:28:01 INFO - 'USER': 'cltbld', 07:28:01 INFO - 'XDG_SESSION_COOKIE': '5bd038846534b2fdfa68eeae000001e2-1474121999.168975-1245787711', 07:28:01 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 07:28:01 INFO - '_': '/tools/buildbot/bin/python'} 07:28:01 INFO - Ignoring indexes: https://pypi.python.org/simple/ 07:28:01 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)) 07:28:01 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)) 07:28:01 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)) 07:28:01 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)) 07:28:01 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)) 07:28:01 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)) 07:28:01 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)) 07:28:01 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)) 07:28:01 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)) 07:28:01 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)) 07:28:01 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)) 07:28:01 INFO - Cleaning up... 07:28:01 INFO - Return code: 0 07:28:01 INFO - Installing jsonschema into virtualenv /builds/slave/test/build/venv 07:28:01 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')]} 07:28:01 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 07:28:01 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:28:01 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')]} 07:28:01 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 07:28:01 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 07:28:01 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x15ff030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x17628a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x182e400>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x18bd570>, '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 0x18be470>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x18be900>, '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': '5bd038846534b2fdfa68eeae000001e2-1474121999.168975-1245787711', '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 07:28:01 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema'] in /builds/slave/test/build 07:28:01 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub jsonschema 07:28:01 INFO - Using env: {'DISPLAY': ':0', 07:28:01 INFO - 'HOME': '/home/cltbld', 07:28:01 INFO - 'LANG': 'en_US.UTF-8', 07:28:01 INFO - 'LANGUAGE': 'en_US:en', 07:28:01 INFO - 'LOGNAME': 'cltbld', 07:28:01 INFO - 'MAIL': '/var/mail/cltbld', 07:28:01 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 07:28:01 INFO - 'MOZ_NO_REMOTE': '1', 07:28:01 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 07:28:01 INFO - 'NO_EM_RESTART': '1', 07:28:01 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 07:28:01 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 07:28:01 INFO - 'PWD': '/builds/slave/test', 07:28:01 INFO - 'SHELL': '/bin/bash', 07:28:01 INFO - 'SHLVL': '1', 07:28:01 INFO - 'TERM': 'linux', 07:28:01 INFO - 'TMOUT': '86400', 07:28:01 INFO - 'USER': 'cltbld', 07:28:01 INFO - 'XDG_SESSION_COOKIE': '5bd038846534b2fdfa68eeae000001e2-1474121999.168975-1245787711', 07:28:01 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 07:28:01 INFO - '_': '/tools/buildbot/bin/python'} 07:28:01 INFO - Ignoring indexes: https://pypi.python.org/simple/ 07:28:01 INFO - Requirement already satisfied (use --upgrade to upgrade): jsonschema in ./venv/lib/python2.7/site-packages 07:28:01 INFO - Cleaning up... 07:28:01 INFO - Return code: 0 07:28:01 INFO - Running post-action listener: _resource_record_post_action 07:28:01 INFO - Running post-action listener: _start_resource_monitoring 07:28:01 INFO - Starting resource monitoring. 07:28:01 INFO - [mozharness: 2016-09-17 14:28:01.490912Z] Finished create-virtualenv step (success) 07:28:01 INFO - [mozharness: 2016-09-17 14:28:01.491388Z] Running install step. 07:28:01 INFO - Running pre-action listener: _resource_record_pre_action 07:28:01 INFO - Running main action method: install 07:28:01 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 07:28:01 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 07:28:01 INFO - Reading from file tmpfile_stdout 07:28:01 INFO - Detecting whether we're running mozinstall >=1.0... 07:28:01 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 07:28:01 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 07:28:01 INFO - Reading from file tmpfile_stdout 07:28:01 INFO - Output received: 07:28:01 INFO - Usage: mozinstall [options] installer 07:28:01 INFO - Options: 07:28:01 INFO - -h, --help show this help message and exit 07:28:01 INFO - -d DEST, --destination=DEST 07:28:01 INFO - Directory to install application into. [default: 07:28:01 INFO - "/builds/slave/test"] 07:28:01 INFO - --app=APP Application being installed. [default: firefox] 07:28:01 INFO - mkdir: /builds/slave/test/build/application 07:28:01 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '/builds/slave/test/build/firefox-50.0a2.en-US.linux-x86_64.tar.bz2', '--destination', '/builds/slave/test/build/application'] 07:28:01 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall /builds/slave/test/build/firefox-50.0a2.en-US.linux-x86_64.tar.bz2 --destination /builds/slave/test/build/application 07:28:18 INFO - Reading from file tmpfile_stdout 07:28:18 INFO - Output received: 07:28:18 INFO - /builds/slave/test/build/application/firefox/firefox 07:28:18 INFO - Running post-action listener: _resource_record_post_action 07:28:18 INFO - [mozharness: 2016-09-17 14:28:18.673527Z] Finished install step (success) 07:28:18 INFO - [mozharness: 2016-09-17 14:28:18.673802Z] Running run-tests step. 07:28:18 INFO - Running pre-action listener: _resource_record_pre_action 07:28:18 INFO - Running main action method: run_tests 07:28:18 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 07:28:18 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 07:28:18 INFO - Python 2.7.3 07:28:18 INFO - Return code: 0 07:28:18 INFO - grabbing minidump binary from tooltool 07:28:18 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://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')]} 07:28:18 INFO - retry: Calling run_command with args: (['/tools/tooltool.py', '--url', 'https://api.pub.build.mozilla.org/tooltool/', '--authentication-file', '/builds/relengapi.tok', 'fetch', '-m', '/builds/slave/test/build/tests/config/tooltool-manifests/linux64/releng.manifest', '-o', '-c', '/builds/tooltool_cache'],), kwargs: {'output_timeout': 600, 'error_list': [{'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x18bd570>, '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 0x18be470>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x18be900>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 07:28:18 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 07:28:18 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 07:28:18 INFO - Calling ['/tools/tooltool.py', '--url', 'https://api.pub.build.mozilla.org/tooltool/', '--authentication-file', '/builds/relengapi.tok', 'fetch', '-m', '/builds/slave/test/build/tests/config/tooltool-manifests/linux64/releng.manifest', '-o', '-c', '/builds/tooltool_cache'] with output_timeout 600 07:28:18 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 07:28:18 INFO - Return code: 0 07:28:18 INFO - Chmoding /builds/slave/test/build/linux64-minidump_stackwalk to 0755 07:28:18 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 07:28:18 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 07:28:18 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/linux64-minidump_stackwalk 07:28:18 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 07:28:18 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Mozilla-Aurora', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/dEe2JI-8Qv2bXOdj8oNC1w/artifacts/public/build/firefox-50.0a2.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-039', '--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 07:28:18 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/tests/talos/talos/run_tests.py --branchName Mozilla-Aurora --suite dromaeojs-e10s --executablePath /builds/slave/test/build/application/firefox/firefox --symbolsPath https://queue.taskcluster.net/v1/task/dEe2JI-8Qv2bXOdj8oNC1w/artifacts/public/build/firefox-50.0a2.en-US.linux-x86_64.crashreporter-symbols.zip --title talos-linux64-ix-039 --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 07:28:18 INFO - Using env: {'DISPLAY': ':0', 07:28:18 INFO - 'HOME': '/home/cltbld', 07:28:18 INFO - 'LANG': 'en_US.UTF-8', 07:28:18 INFO - 'LANGUAGE': 'en_US:en', 07:28:18 INFO - 'LOGNAME': 'cltbld', 07:28:18 INFO - 'MAIL': '/var/mail/cltbld', 07:28:18 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 07:28:18 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/linux64-minidump_stackwalk', 07:28:18 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 07:28:18 INFO - 'MOZ_NO_REMOTE': '1', 07:28:18 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 07:28:18 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 07:28:18 INFO - 'NO_EM_RESTART': '1', 07:28:18 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 07:28:18 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 07:28:18 INFO - 'PWD': '/builds/slave/test', 07:28:18 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 07:28:18 INFO - 'SHELL': '/bin/bash', 07:28:18 INFO - 'SHLVL': '1', 07:28:18 INFO - 'TERM': 'linux', 07:28:18 INFO - 'TMOUT': '86400', 07:28:18 INFO - 'USER': 'cltbld', 07:28:18 INFO - 'XDG_SESSION_COOKIE': '5bd038846534b2fdfa68eeae000001e2-1474121999.168975-1245787711', 07:28:18 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 07:28:18 INFO - '_': '/tools/buildbot/bin/python'} 07:28:18 INFO - Calling ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Mozilla-Aurora', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/dEe2JI-8Qv2bXOdj8oNC1w/artifacts/public/build/firefox-50.0a2.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-039', '--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 07:28:18 INFO - mozversion application_buildid: 20160917004009 07:28:18 INFO - mozversion application_changeset: b9499912b32324acd84792bf02b533b40e98e496 07:28:18 INFO - mozversion application_display_name: FirefoxDeveloperEdition 07:28:18 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 07:28:18 INFO - mozversion application_name: Firefox 07:28:18 INFO - mozversion application_remotingname: firefox-dev 07:28:18 INFO - mozversion application_repository: https://hg.mozilla.org/releases/mozilla-aurora 07:28:18 INFO - mozversion application_vendor: Mozilla 07:28:18 INFO - mozversion application_version: 50.0a2 07:28:18 INFO - mozversion platform_buildid: 20160917004009 07:28:18 INFO - mozversion platform_changeset: b9499912b32324acd84792bf02b533b40e98e496 07:28:18 INFO - mozversion platform_repository: https://hg.mozilla.org/releases/mozilla-aurora 07:28:18 INFO - mozversion platform_version: 50.0a2 07:28:18 INFO - using testdate: 1474122498 07:28:18 INFO - actual date: 1474122498 07:28:18 INFO - starting webserver on 'localhost:55990' 07:28:18 INFO - SUITE-START | Running 2 tests 07:28:18 INFO - TEST-START | dromaeo_css 07:28:18 INFO - operating with platform_type : linux_ 07:28:18 INFO - Initialising browser for dromaeo_css test... 07:28:18 INFO - TEST-INFO | started process 24463 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpB3Uw79/profile http://localhost:55990/getInfo.html) 07:28:23 INFO - PROCESS | 24463 | __metrics Screen width/height:1600/1200 07:28:23 INFO - PROCESS | 24463 | colorDepth:24 07:28:23 INFO - PROCESS | 24463 | Browser inner width/height: 1024/697 07:28:23 INFO - PROCESS | 24463 | __metrics 07:28:24 ERROR - PROCESS | 24463 | JavaScript error: chrome://browser/content/tabbrowser.xml, line 2967: TypeError: this.tabs is undefined 07:28:25 INFO - TEST-INFO | 24463: exit 0 07:28:25 INFO - Browser initialized. 07:28:25 INFO - Running cycle 1/1 for dromaeo_css test... 07:28:25 INFO - TEST-INFO | started process 24586 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpB3Uw79/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 07:28:36 INFO - PROCESS | 24586 | RSS: Main: 153845760 07:28:36 INFO - PROCESS | 24586 | 07:29:26 INFO - PROCESS | 24586 | 1474122566468 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] 07:31:34 INFO - PROCESS | 24586 | Cycle 1(1): loaded http://localhost:55990/tests/dromaeo/cssquery-dojo.html (next: http://localhost:55990/tests/dromaeo/cssquery-ext.html) 07:31:36 INFO - PROCESS | 24586 | RSS: Main: 160022528 07:31:36 INFO - PROCESS | 24586 | 07:34:38 INFO - PROCESS | 24586 | Cycle 1(1): loaded http://localhost:55990/tests/dromaeo/cssquery-ext.html (next: http://localhost:55990/tests/dromaeo/cssquery-jquery.html) 07:34:38 INFO - PROCESS | 24586 | RSS: Main: 155623424 07:34:38 INFO - PROCESS | 24586 | 07:37:40 INFO - PROCESS | 24586 | Cycle 1(1): loaded http://localhost:55990/tests/dromaeo/cssquery-jquery.html (next: http://localhost:55990/tests/dromaeo/cssquery-mootools.html) 07:37:41 INFO - PROCESS | 24586 | RSS: Main: 156598272 07:37:41 INFO - PROCESS | 24586 | 07:40:43 INFO - PROCESS | 24586 | Cycle 1(1): loaded http://localhost:55990/tests/dromaeo/cssquery-mootools.html (next: http://localhost:55990/tests/dromaeo/cssquery-prototype.html) 07:40:43 INFO - PROCESS | 24586 | RSS: Main: 154914816 07:40:43 INFO - PROCESS | 24586 | 07:43:46 INFO - PROCESS | 24586 | Cycle 1(1): loaded http://localhost:55990/tests/dromaeo/cssquery-prototype.html (next: http://localhost:55990/tests/dromaeo/cssquery-yui.html) 07:43:46 INFO - PROCESS | 24586 | RSS: Main: 157249536 07:43:46 INFO - PROCESS | 24586 | 07:46:49 INFO - PROCESS | 24586 | Cycle 1(1): loaded http://localhost:55990/tests/dromaeo/cssquery-yui.html (next: http://localhost:55990/tests/dromaeo/cssquery-dojo.html) 07:46:49 INFO - PROCESS | 24586 | RSS: Main: 158363648 07:46:49 INFO - PROCESS | 24586 | 07:46:49 INFO - PROCESS | 24586 | __start_tp_report 07:46:49 INFO - PROCESS | 24586 | _x_x_mozilla_page_load 07:46:49 INFO - PROCESS | 24586 | _x_x_mozilla_page_load_details 07:46:49 INFO - PROCESS | 24586 | |i|pagename|runs| 07:46:49 INFO - PROCESS | 24586 | |0;dojo.html;3270.231495598534;3295.8187299698507;3304.273059926816;3309.6524864889184;3324.3517514084765;5736.082226843706;5743.856403589913;5806.564507661927;5811.128330750379;5819.9127013094785;5708.457696518824;5781.364049954502;5783.074708046714;5798.5361171106315;5836.445537673925;5199.038177937085;5264.578833693296;5284.101702710529;5311.044012077825;5339.092354299778;5110.923336149942;5194.662346947455;5195.038917800201;5217.165253559431;5241.79032838686;5193.45468725784;5224.39919409269;5243.554297884684;5254.343207099113;5297.602679799012;5289.576833853283;5296.788128474856;5308.522232999048;5310;5319.042572336978;5110.054639891595;5154.304168937183;5163.457836927106;5199.272101905736;5211.166213405837;5708.372079071299;5732.742026608813;5756.769729210869;5764.394738552433;5804.216430781833;6182.443580077769;6190.783322583733;6231.127642130105;6232.40792124752;6262.812115636538;5977.641341519479;6129.233845769279;6144.5698801083945;6286.968565157145;6296.496280297565;5785.479306862402;5800.5939584229545;5803.53571714266;5805.970970145165;5837.64974101551;6320.5575609706875;6346.650934198663;6358.523110766711;6366.490680745529;6377.553571249968;5988.730507127189;6010.549208809357;6035.426634469718;6111.419415155553;6113.724882380304;6193.535484838565;6238.157848690459;6243.656598887014;6250.812345654311;6254.312025677263;6197.96901015492;6209.627422354673;6215.12988181655;6227.1282020517165;6238.313785483593;5967.6121052131475;6114.755409783648;6137.193127861533;6159.4456498915315;6173.32093469718;4772.069446457907;4773.093112308719;4774.570288674036;4782.210935195653;4801.423829140455;4239.872803815891;4244.915101697949;4251.319788833772;4253.04306531028;4272.359146128106;5757.712114394263;5916.467517923407;5924.229850119543;6029.78895738647;6057.061155520902;6252.937470625327;6267.968660156761;6299.401556852092;6301.243850737941;6302.306746257908;5969.432903874125;6020.127081573148;6021.548383871227;6032.668203248863;6063.818085457443;5055.7219352935945;5068.315777370081;5089.414717307557;5186.118359878829;5197.948020519822;6365.204349456318;6403.263624683128;6416.390442907917;6416.486681065504;6423.454006409414;6141.048137538689;6149.631022138686;6172.074188871705;6198.938010619926;6216.595921265284;6156.507479401547;6298.212723409574;6365.745370185141;6400.39196276353;6431.163948686828;6115.209918062711;6148.354422785543;6163.784267550794;6164.4143806338325;6178.66017369031;6281.842953926189;6292.370762923671;6293.181886354744;6293.496520278458;6293.779717710041;5933.228680271537;5935.673537955454;5982;6039;6113.5414843886;6003.7898673546215;6016.398360163948;6018.307894592178;6022.969885150546;6048.788292409745;6000.969995149996;6008.519318454426;6056.485198758155;6056.6971651418135;6067.605605635797;5923.466887980103;6036.0644100164545;6047.848803779941;6073.453389194994;6075.2405949256345;5919.940800591939;5981.1327357532045;5982.910256346246;6003.6397816131175;6008.909866351921 07:46:49 INFO - PROCESS | 24586 | |1;ext.html;576.3947854752508;627.9560430769848;645.1999520594463;654.1986067067843;655.3217419970332;41640.16719665609;46215.07569848601;46286.07427851441;46352;46387.53612463874;45778.77110614442;45791.542084579225;46098.53901460993;46222.30666540004;46397.7680111599;8981.461112333282;9155.954220228923;9200;9212.585433655502;9213.493257870814;9133.132352426508;9222.492762898039;9223.723288301362;9226.400283981553;9239.307051971095;9135.36052476327;9237.12247336502;9266.953665231664;9271.675491357804;9287.860682089775;9184.403013804114;9226.031266716998;9250.398724082947;9276.11876871696;9294.117058879396;9106.590203440861;9181.954090229507;9207.493587852665;9208.401453905475;9251.167394934488;36385.27229455396;36857.26285474302;36873.262534749425;36911.44632830509;36929.815350923076;4036.091879327128;4054.7161698681102;4133.627973482371;4159.334506478979;4218.641415479688;34180.82909585461;34371.65628343709;34717;34776.30447391063;35784.46323305152;4706.3411122442885;4711.552402521755;4718.103560323528;4737.786799593992;4811;362473;363356;365134;365453.1727341373;366759;60416.69791651014;60879.39120608826;61083.6945815277;61217;61563.384366156664;39567.40648890269;40200.59799402027;40640.39039414411;41823.58176418258;41984.79007604942;19238;19262.518437039187;19286.903565482364;19367.12847921847;19411.320603779084;14889;14920.477783277533;14938.775918361232;15024.924875375553;15035.398584056515;20575;20785.1685932561;20917.686234706493;20940.47648808792;20984.160633574793;7529.661165247577;7597.5821329826285;7777.805554861061;7782.638038343381;7911.84176316482;1052.6000119954522;1102.5204036244259;1117.9105671546256;1118.4743170709753;1128.1087940527057;33997.32005359879;34810.825945870616;34965.825170873984;35146.64853351434;35186.47220291698;1139.9031082357926;1150.3040660400504;1209.564556759566;1215.665691934725;1232.89520390766;16824.663506729798;17237.28813559322;17324.65350692979;17469.21388537519;17794.822051779316;456583;642561;648878;650013;880719;65036.674816625615;66225;66287.33712662908;66310.33689663139;66326.33673663298;1474.506040476431;1489.7690857917041;1504.247876061969;1508.7058023685277;1535.554689140159;34239.315213696085;35024;35127.29745405129;35239.295214096084;35437.64562354344;55444.72277638586;55709;55916.72041639766;56106.438935610124;56240;529080;530164;531040;531459;531751;31562.526562102044;31774.841125794224;32230.516542252353;32330.83834580906;32396.838015810714;51474;51589.48410515997;51898.48101518936;52434.47565524449;52912.735436322575;44245.336319954586;44661.55338446574;44926;45420.772896135306;46309.53690463052;42487.3626895603;42661.78669106634;43609.56390436182;44322.55677443184;44595;43941.78029109834;44125.55874441215;45139.645810625734;45495.31757023714;45742.313865291384;37551;39758.403623946244;39811.60188398195;39827;40348;29786.851065744533;30107.69892301049;30381.696183037886;30977.535336970413;31047 07:46:49 INFO - PROCESS | 24586 | |2;jquery.html;390.88468901673986;395.6379912380172;424.64542107340367;430.63180980261876;431.0753433884318;19177.52056198594;20174.39476815694;20557.691634625473;21111.366659000236;21130.260440884573;19728.21087156512;19763.407097787054;19815.900920495413;20374;20525.384238472834;5639.661620302774;5815.82552523425;5854.238948936632;5861.267341582302;5867.119932010211;5785.334686511042;5786.56600754943;5827.213326200972;5870.970645146768;5942.5840191186635;5865.706714664271;5883.29400471944;5886.323072846634;5940.138679891413;5942.257217847769;5753.741081651315;5791.623544469617;5836.854078648025;5887.558433117533;5904.350521442638;5101.846944591668;5224.686518808846;5231.163013917755;5232.686038837682;5235.921461178047;24296.392590185387;24614.753852461425;24636.630450543256;25069.37326566832;25194;2595.779358754508;2625.842449453039;2788.261110805638;2876.7267109624554;2900.666423361319;7644.312011918954;7791.181925897812;11808.704782380424;15564;15993.920030399773;1882.1342182596022;1923.7005293169755;1940.7865134835156;1978.3669225847734;1987.3243097346972;67175.3282467174;85137;87018.12981870226;87499.56250218708;87564.56217718935;11086.501107450184;11122.110231181487;11378.374189419495;11518.675352334589;11598.652040438632;16088.195590220676;16243.918780406022;16267.59331016734;16272.430464933906;16314.34742610306;8377.916220837713;8468.153184681483;8524.488530688179;8527.104654011364;8656.047834738174;8267;8283.130271321545;8378.958105209556;8396.580170991427;8427.41008129425;7068.929310706827;7128.895021271711;7163.140423149255;7174.713011479483;7190.892136617955;2023.3626407681827;2086.3636590839938;2124.776898425674;2133.423975526599;2145.8712477251415;1048.528162326956;1069.3476979042778;1110.1784679337231;1114.2868564118971;1132.7111586545377;21275.680864787042;21452.24917127893;21502.677459838116;21585.136594536358;21621.13515459364;1088.542812018954;1115.0856297835696;1155.2894969593808;1176.300101439642;1183.402381797187;12000;12050.457729402198;12137.5144994201;12150.5139794409;12209.023278137727;477587;478469;495537;543481;545191;82737;85198;85470.57264713636;87451;88838;1100.878903320634;1121.5738019552518;1126.2679258482053;1129.4635048351968;1137.3176094343328;17921.910390447963;18919;18999.810001900358;19060.523486912938;19114;40396;41731;42477.362839556816;42700.7189784307;42770;54768.45231547634;56014.439855600926;56030;56169.43830561805;56846.7157664209;7910.2089791020435;8192.795180120545;8224.465409748347;8498.431730654615;9478.38390504615;12403.875961240272;13845.51540696111;13923.164610123426;14660.193689347188;14688.779668305198;12810.295433751233;12813.295268760308;12896.8065479016;13078.934605326913;13111.2133272004;12249.632511024683;12451.377431128227;12479.500819967463;12504.249745015328;12576.87423125757;12285.262884226975;12626.747465050832;12697.42861571213;12702.6027137013;13095.148815326973;7911.248431399008;8372.120927302545;8387.035490918623;8502.659893604186;8871.822563548563;5641;9442.622295108393;12229.816552751894;12274.140810143204;12385.071119665881 07:46:49 INFO - PROCESS | 24586 | |3;mootools.html;1541.7918580991566;1565.9921700391496;1709.9658006839857;1835.9449216523492;1858.6096919646873;8344.582770861447;8883.333749968746;8966.730998070052;9746.902530974688;9755.609775608986;8960.462372257669;9291.070892910706;9330.626774928995;9339.3462457628;9340.906590934088;2481.0323973650334;2510.8493490390542;2514.170323793153;2515.4969006198835;2516.169664010881;2421.1889017179265;2483.50329934013;2502.27434044127;2505.8496490210646;2515.811314151437;2451.105346548506;2476.7523247675267;2520.6849143857016;2525.103588226181;2532.012515119105;2380.27401642499;2394.7006624171977;2401.9279421617466;2408.3617841272076;2420.649005894153;2401.519696060795;2409.8915548800346;2427.3446169534127;2436.988649710368;2451;9243.76890577741;9291.024442433514;9296.070392960717;9338.159565639056;9346.15884570392;5432.809851655173;5529;5541.307336582927;5562.916556251659;5571.1086226203615;3473.409520381516;3539.752217344787;3604.891853244407;3685;3686.8525258989607;1193.4271549656128;1194.2058531076823;1196.0491409329604;1223.62067758995;1234.6481252842896;13445.462181512825;13448.731025379535;13504;13516.256605886672;13584.660383490393;4825.662203645781;4909.975450122726;4936.185529387682;4948.579370753454;5130.948690513047;11138.108951283877;11211.831822522669;11217;11227.157963152797;11246.66260012201;5548.334199896039;5557.888842223214;5562.916556251659;5575.135853942646;5605.7197140142825;4652.185867473178;5027.79888804451;5110.693358398508;5174.560162386164;5190.377154741455;4354.608085272277;4380.102079073782;4451.844185453494;4456.598906098467;4485.842995495207;1378.2144177818548;1387.5767890793204;1387.6877702516854;1390.8719658921664;1433.5269361111018;987.4223579206244;988.658912675126;1010.2776514791813;1010.4594042187395;1046.2937517175876;5896.321922978912;5971.79098731551;6017.247844019497;6024.548158888013;6167.136600875881;485.09287632128144;485.9149648811444;490.5707505932309;493.1640868727544;494.7921872813427;4153.439285696392;4184.639992002551;4254.957450425518;4303.720258183208;4364.759938203366;11296;11551.249168804;11804.822927656092;11849.111316651286;11893.583724569771;11658.6502404928;11667.42489763871;11677.35774532392;11704.765904681859;11707.765844683228;8237.83524329522;8614.82770344602;8669.566521673765;8866.069062748318;9003.729888103368;6293.96853015732;6335.334789847;6390.297067322498;6434.324395938546;6634.601923884582;10327.638532651321;10437.373757574569;10632.946835265775;10642.627508037182;10666.73333166677;10795.676129716121;10825.350478971286;10892.727681808019;10923.672289831318;11142.554297827995;8150.9184908150155;8175.918240817516;8249.340052795882;8302.377321701017;8307.83384332322;8931.821363572823;8949.194572488508;8993.055729148346;9071.319651026331;9078.31912606544;7947.086085100287;7948.642311095899;8050.476719013245;8058.194180581895;8150.877736834071;7977.920220797718;7993.280604745601;7997.7600671979935;8050.919490805251;8153.714619988272;7400.592967386845;7425.183229844604;7461.776146715607;7466.440016998856;7546.2831031051965;5502.669839809624;5508.14623733322;5546.585620666704;5610.747516361856;5670.574706897081;5441.591880609049;5580;5588.161775733673;5634.971825140848;5644.322681278273 07:46:49 INFO - PROCESS | 24586 | |4;prototype.html;314.38537658876896;318.4193741378202;320.88127392864635;329.6341061421823;330.47619523055954;5837.416258374161;5860.179574859518;5881.647101173932;5887.617304875191;5913.2017177681055;5746.1668058131545;5751.166080918264;5768.567357448198;5789.652620842752;5795.4784069433745;4248.447701798762;4331.978340108295;4447.444069491314;4491.146682130401;4499.145162419146;4445.39987101742;4480.327950807388;4497.955020449803;4506.8873278167985;4524.45706515217;4460.397846290758;4462.482755863006;4465.575770301816;4496.550344965493;4505.760915748163;4334.97832510837;4462.397576327203;4482.753448560328;4491.865244042684;4494.640428765691;3950.6839452843706;3957.168994511156;3958.940615890764;3966.365381538969;3973.1127714335457;5610.523105536035;5631.746571404296;5635.492805647511;5647.8588035299035;5654.46282603152;4976.477469865648;5108.591312694975;5109.284700141983;5133.666311689728;5151.381834179885;5973.462388385066;5995;6002.628961560203;6013.458788708994;6021.397860213988;4254.787260636956;4297.914041719148;4298.097399546068;4301.161273551658;4348.673849461272;6272.843178920518;6311.747530098836;6315.431611154972;6315.8526101125835;6317.715702793339;4416.293393057095;4425.446819147606;4435.491932742883;4435.955640443619;4455.6658250631335;4095.795210239476;4458.71018383804;4487.528809475023;4493.281075028045;4494.943688233263;4977.65156439053;5012.273220383097;5014.89970200594;5028.748562571856;5039.748012599355;6103.328633850273;6134.2332208473945;6151.9234134026365;6153.753849845956;6161.537884658668;1482.561310604033;1491.7613181890845;1500.4598344595936;1507.5025241670223;1514.5834895403852;926.0693003531408;930.1953809954341;958.9499498049624;988.7874107067015;1002.3584905660383;5835.912461313083;5840.386759390288;5841.94158058414;5848.239728835224;5910.202122713465;6171.068742347439;6191.226096737908;6231.719572619152;6231.813045608548;6235.594686345373;5738.68437235956;5892.941070589325;5905.202797622352;5907.075997381238;5915.1718759373725;3322.767406281537;3324.1357247115925;3338.5659864217982;3350.3131857969547;3355.765096443274;6046.007226422861;6383.680815959184;6400.839979000562;6431.228252609717;6446.484281257488;6310.968445157745;6333.524985626096;6335.176427064452;6336.510919933812;6391.265004524446;6207.937920620826;6310.968445157745;6444.421116826314;6470.611763294123;6477.578957367756;6180.7527698891545;6188.566800323934;6240.7503699851495;6247.219097612799;6255.593386429868;6115.969420152871;6122.357152498924;6123.805857857853;6152.7390483044055;6157.89157951573;6156.846078848064;6317.873642527032;6369.598688288569;6384.6169229846355;6422.3577642235405;4237.512686041021;4250.638695710775;4264.786760662017;4270.615644592001;4273.615374616299;5902.61632993854;6130.417610327012;6156.630602163885;6217.813465596039;6218.409251121137;6055.757769689163;6056.152138700673;6064.06007068905;6069.423404776539;6071.878562428815;6026.523501742101;6043.791241751579;6053.455189032832;6059.3334733178435;6076.605020673642;5803.47768700819;6028.950156946659;6032.974394353058;6057.454829065406;6164.137020817179;6216.409441103269;6240.7503699851495;6241.78153764616;6244.843878903063;6290.622562646256;5950.880982380415;6059.666718330534;6062.302835174011;6089.512838972783;6097.817065487865 07:46:49 INFO - PROCESS | 24586 | |5;yui.html;858.4591707224448;866.4801119328407;891.482939894861;914.0996118822962;926.1525703980856;16718.33126674933;18636;18661;18714.344997925076;18736.156872940715;16415.425460108898;16611.584710382216;16641.1679416029;16727.66544669106;16806.83193168068;868.8392647360258;874.8556488179443;887.2148148888248;891.8751374807499;908.9818203635956;892.0633334998258;897.7531178925815;899.5637115998768;899.7075950316141;899.8110396816676;961.2454223434605;961.403929563668;961.7403301108732;961.7691753979065;961.9278554108434;949.1931857920781;958.1855422890523;958.4967891856761;959.2853324273461;960.0207788056143;700.8037749430167;703.0263085626393;703.6938931564786;703.968321425537;705.4250785609712;16438.095904725236;16466.75299870503;16499.257533410906;16511.504654860375;16602.916985414995;14099.71800563983;14322.355494002795;14415;14965.850341496664;15098.396064157421;14462.566123016326;14729.852701472955;14805.111693298437;14808.925955370261;15104.471343503035;4668.906621867543;4738.384010078702;4782.856514304542;4816.109019831342;4990.451050384455;86123;86169.13830861673;87140.56429717875;91210;92914.53542732244;12125.151239413157;12284.324362160167;12688.429020694091;12733.745325093447;12927.806082908764;22947.311580652608;22976.655350169425;23171.76828231696;23172.768272317397;23397.7660223399;9436.292278079172;9466.29002824791;9486.288528360401;9531.571079301448;9818.410895346302;5016.297718319365;5077.31456253401;5114.360704911886;5123.308353372247;5228.712420816892;3755.117547376364;3820.9235815284096;3821.121142137324;3877.689784817208;3900.0444891001885;646.741303478603;651.4104735214638;659.5745743995096;669.9765508207189;674.7672053141658;814.0882211922566;825.8885050518103;844.6452489954233;851.5742128935532;870.2168048756043;11144.2199046066;11150.888491114985;11444;11656.125790565571;11877.643670689893;743.1008479739468;821.3798582070499;825.3149885594942;850.6427300533791;854.7222152800365;4836.758162091952;5219.42586315505;5302.416734159239;5312.495312945264;5318.654287471302;129715;129989;130220;132291;132418;92137;94456.69401570912;117124;117543;117723;52088.47911520836;60892.695536522035;90738;90981;92161;9729.610815567581;10690.198235132551;10702.678919632424;10873.945630271797;10997;53268;54031.72984135054;54419.45580544144;54987.72506137444;55262.72368638292;73233;81375.59312203401;81844.59077704573;82611;83589;14266.71466570642;14381.568552943429;14395.208263545606;14524.49164279245;14684.85315146835;15749.685006300038;16037.117958512394;16135.838641613904;16969.660606788042;17544.298228070733;15285.465008724641;15382.538523844303;16291.674166516841;16300.918495407921;16684.833151668812;14510.709785804436;14633.268336583342;15023.248837558296;15271.847281527043;15827.683446331239;14172.929135354258;14581.270936453348;14705.70588588201;14763.483278085216;15075.472358467401;11833.585824496446;12914.483420663444;13012.284324361872;13278.86721132815;13316.533921312708;12897.548585799452;13162.670933226746;13348.199108053159;13507.932460337635;13880.583582492542 07:46:49 INFO - PROCESS | 24586 | __end_tp_report 07:46:49 INFO - PROCESS | 24586 | __start_cc_report 07:46:49 INFO - PROCESS | 24586 | _x_x_mozilla_cycle_collect,335 07:46:49 INFO - PROCESS | 24586 | __end_cc_report 07:46:49 INFO - PROCESS | 24586 | __startTimestamp1474123609575__endTimestamp 07:46:49 INFO - PROCESS | 24586 | 07:46:49 INFO - PROCESS | 24586 | ------- Summary: start ------- 07:46:49 INFO - PROCESS | 24586 | Number of tests: 6 07:46:49 INFO - PROCESS | 24586 | 07:46:49 INFO - PROCESS | 24586 | [#0] dojo.html Cycles:165 Average:5751.29 Median:6008.52 stddev:666.46 (11.1%) stddev-sans-first:639.45 07:46:49 INFO - PROCESS | 24586 | Values: 3270.2 3295.8 3304.3 3309.7 3324.4 5736.1 5743.9 5806.6 5811.1 5819.9 5708.5 5781.4 5783.1 5798.5 5836.4 5199.0 5264.6 5284.1 5311.0 5339.1 5110.9 5194.7 5195.0 5217.2 5241.8 5193.5 5224.4 5243.6 5254.3 5297.6 5289.6 5296.8 5308.5 5310.0 5319.0 5110.1 5154.3 5163.5 5199.3 5211.2 5708.4 5732.7 5756.8 5764.4 5804.2 6182.4 6190.8 6231.1 6232.4 6262.8 5977.6 6129.2 6144.6 6287.0 6296.5 5785.5 5800.6 5803.5 5806.0 5837.6 6320.6 6346.7 6358.5 6366.5 6377.6 5988.7 6010.5 6035.4 6111.4 6113.7 6193.5 6238.2 6243.7 6250.8 6254.3 6198.0 6209.6 6215.1 6227.1 6238.3 5967.6 6114.8 6137.2 6159.4 6173.3 4772.1 4773.1 4774.6 4782.2 4801.4 4239.9 4244.9 4251.3 4253.0 4272.4 5757.7 5916.5 5924.2 6029.8 6057.1 6252.9 6268.0 6299.4 6301.2 6302.3 5969.4 6020.1 6021.5 6032.7 6063.8 5055.7 5068.3 5089.4 5186.1 5197.9 6365.2 6403.3 6416.4 6416.5 6423.5 6141.0 6149.6 6172.1 6198.9 6216.6 6156.5 6298.2 6365.7 6400.4 6431.2 6115.2 6148.4 6163.8 6164.4 6178.7 6281.8 6292.4 6293.2 6293.5 6293.8 5933.2 5935.7 5982.0 6039.0 6113.5 6003.8 6016.4 6018.3 6023.0 6048.8 6001.0 6008.5 6056.5 6056.7 6067.6 5923.5 6036.1 6047.8 6073.5 6075.2 5919.9 5981.1 5982.9 6003.6 6008.9 07:46:49 INFO - PROCESS | 24586 | 07:46:49 INFO - PROCESS | 24586 | [#1] ext.html Cycles:180 Average:67632.60 Median:44185.45 stddev:143202.03 (324.1%) stddev-sans-first:143515.25 07:46:49 INFO - PROCESS | 24586 | Values: 576.4 628.0 645.2 654.2 655.3 41640.2 46215.1 46286.1 46352.0 46387.5 45778.8 45791.5 46098.5 46222.3 46397.8 8981.5 9156.0 9200.0 9212.6 9213.5 9133.1 9222.5 9223.7 9226.4 9239.3 9135.4 9237.1 9267.0 9271.7 9287.9 9184.4 9226.0 9250.4 9276.1 9294.1 9106.6 9182.0 9207.5 9208.4 9251.2 36385.3 36857.3 36873.3 36911.4 36929.8 4036.1 4054.7 4133.6 4159.3 4218.6 34180.8 34371.7 34717.0 34776.3 35784.5 4706.3 4711.6 4718.1 4737.8 4811.0 362473.0 363356.0 365134.0 365453.2 366759.0 60416.7 60879.4 61083.7 61217.0 61563.4 39567.4 40200.6 40640.4 41823.6 41984.8 19238.0 19262.5 19286.9 19367.1 19411.3 14889.0 14920.5 14938.8 15024.9 15035.4 20575.0 20785.2 20917.7 20940.5 20984.2 7529.7 7597.6 7777.8 7782.6 7911.8 1052.6 1102.5 1117.9 1118.5 1128.1 33997.3 34810.8 34965.8 35146.6 35186.5 1139.9 1150.3 1209.6 1215.7 1232.9 16824.7 17237.3 17324.7 17469.2 17794.8 456583.0 642561.0 648878.0 650013.0 880719.0 65036.7 66225.0 66287.3 66310.3 66326.3 1474.5 1489.8 1504.2 1508.7 1535.6 34239.3 35024.0 35127.3 35239.3 35437.6 55444.7 55709.0 55916.7 56106.4 56240.0 529080.0 530164.0 531040.0 531459.0 531751.0 31562.5 31774.8 32230.5 32330.8 32396.8 51474.0 51589.5 51898.5 52434.5 52912.7 44245.3 44661.6 44926.0 45420.8 46309.5 42487.4 42661.8 43609.6 44322.6 44595.0 43941.8 44125.6 45139.6 45495.3 45742.3 37551.0 39758.4 39811.6 39827.0 40348.0 29786.9 30107.7 30381.7 30977.5 31047.0 07:46:49 INFO - PROCESS | 24586 | 07:46:49 INFO - PROCESS | 24586 | [#2] jquery.html Cycles:180 Average:29840.23 Median:13894.89 stddev:83641.21 (602.0%) stddev-sans-first:83846.61 07:46:49 INFO - PROCESS | 24586 | Values: 390.9 395.6 424.6 430.6 431.1 19177.5 20174.4 20557.7 21111.4 21130.3 19728.2 19763.4 19815.9 20374.0 20525.4 5639.7 5815.8 5854.2 5861.3 5867.1 5785.3 5786.6 5827.2 5871.0 5942.6 5865.7 5883.3 5886.3 5940.1 5942.3 5753.7 5791.6 5836.9 5887.6 5904.4 5101.8 5224.7 5231.2 5232.7 5235.9 24296.4 24614.8 24636.6 25069.4 25194.0 2595.8 2625.8 2788.3 2876.7 2900.7 7644.3 7791.2 11808.7 15564.0 15993.9 1882.1 1923.7 1940.8 1978.4 1987.3 67175.3 85137.0 87018.1 87499.6 87564.6 11086.5 11122.1 11378.4 11518.7 11598.7 16088.2 16243.9 16267.6 16272.4 16314.3 8377.9 8468.2 8524.5 8527.1 8656.0 8267.0 8283.1 8379.0 8396.6 8427.4 7068.9 7128.9 7163.1 7174.7 7190.9 2023.4 2086.4 2124.8 2133.4 2145.9 1048.5 1069.3 1110.2 1114.3 1132.7 21275.7 21452.2 21502.7 21585.1 21621.1 1088.5 1115.1 1155.3 1176.3 1183.4 12000.0 12050.5 12137.5 12150.5 12209.0 477587.0 478469.0 495537.0 543481.0 545191.0 82737.0 85198.0 85470.6 87451.0 88838.0 1100.9 1121.6 1126.3 1129.5 1137.3 17921.9 18919.0 18999.8 19060.5 19114.0 40396.0 41731.0 42477.4 42700.7 42770.0 54768.5 56014.4 56030.0 56169.4 56846.7 7910.2 8192.8 8224.5 8498.4 9478.4 12403.9 13845.5 13923.2 14660.2 14688.8 12810.3 12813.3 12896.8 13078.9 13111.2 12249.6 12451.4 12479.5 12504.2 12576.9 12285.3 12626.7 12697.4 12702.6 13095.1 7911.2 8372.1 8387.0 8502.7 8871.8 5641.0 9442.6 12229.8 12274.1 12385.1 07:46:49 INFO - PROCESS | 24586 | 07:46:49 INFO - PROCESS | 24586 | [#3] mootools.html Cycles:180 Average:6159.12 Median:485.50 stddev:3545.71 (730.3%) stddev-sans-first:3538.68 07:46:49 INFO - PROCESS | 24586 | Values: 1541.8 1566.0 1710.0 1835.9 1858.6 8344.6 8883.3 8966.7 9746.9 9755.6 8960.5 9291.1 9330.6 9339.3 9340.9 2481.0 2510.8 2514.2 2515.5 2516.2 2421.2 2483.5 2502.3 2505.8 2515.8 2451.1 2476.8 2520.7 2525.1 2532.0 2380.3 2394.7 2401.9 2408.4 2420.6 2401.5 2409.9 2427.3 2437.0 2451.0 9243.8 9291.0 9296.1 9338.2 9346.2 5432.8 5529.0 5541.3 5562.9 5571.1 3473.4 3539.8 3604.9 3685.0 3686.9 1193.4 1194.2 1196.0 1223.6 1234.6 13445.5 13448.7 13504.0 13516.3 13584.7 4825.7 4910.0 4936.2 4948.6 5130.9 11138.1 11211.8 11217.0 11227.2 11246.7 5548.3 5557.9 5562.9 5575.1 5605.7 4652.2 5027.8 5110.7 5174.6 5190.4 4354.6 4380.1 4451.8 4456.6 4485.8 1378.2 1387.6 1387.7 1390.9 1433.5 987.4 988.7 1010.3 1010.5 1046.3 5896.3 5971.8 6017.2 6024.5 6167.1 485.1 485.9 490.6 493.2 494.8 4153.4 4184.6 4255.0 4303.7 4364.8 11296.0 11551.2 11804.8 11849.1 11893.6 11658.7 11667.4 11677.4 11704.8 11707.8 8237.8 8614.8 8669.6 8866.1 9003.7 6294.0 6335.3 6390.3 6434.3 6634.6 10327.6 10437.4 10632.9 10642.6 10666.7 10795.7 10825.4 10892.7 10923.7 11142.6 8150.9 8175.9 8249.3 8302.4 8307.8 8931.8 8949.2 8993.1 9071.3 9078.3 7947.1 7948.6 8050.5 8058.2 8150.9 7977.9 7993.3 7997.8 8050.9 8153.7 7400.6 7425.2 7461.8 7466.4 7546.3 5502.7 5508.1 5546.6 5610.7 5670.6 5441.6 5580.0 5588.2 5635.0 5644.3 07:46:49 INFO - PROCESS | 24586 | 07:46:49 INFO - PROCESS | 24586 | [#4] prototype.html Cycles:180 Average:5094.42 Median:5890.28 stddev:1522.62 (25.8%) stddev-sans-first:1484.02 07:46:49 INFO - PROCESS | 24586 | Values: 314.4 318.4 320.9 329.6 330.5 5837.4 5860.2 5881.6 5887.6 5913.2 5746.2 5751.2 5768.6 5789.7 5795.5 4248.4 4332.0 4447.4 4491.1 4499.1 4445.4 4480.3 4498.0 4506.9 4524.5 4460.4 4462.5 4465.6 4496.6 4505.8 4335.0 4462.4 4482.8 4491.9 4494.6 3950.7 3957.2 3958.9 3966.4 3973.1 5610.5 5631.7 5635.5 5647.9 5654.5 4976.5 5108.6 5109.3 5133.7 5151.4 5973.5 5995.0 6002.6 6013.5 6021.4 4254.8 4297.9 4298.1 4301.2 4348.7 6272.8 6311.7 6315.4 6315.9 6317.7 4416.3 4425.4 4435.5 4436.0 4455.7 4095.8 4458.7 4487.5 4493.3 4494.9 4977.7 5012.3 5014.9 5028.7 5039.7 6103.3 6134.2 6151.9 6153.8 6161.5 1482.6 1491.8 1500.5 1507.5 1514.6 926.1 930.2 958.9 988.8 1002.4 5835.9 5840.4 5841.9 5848.2 5910.2 6171.1 6191.2 6231.7 6231.8 6235.6 5738.7 5892.9 5905.2 5907.1 5915.2 3322.8 3324.1 3338.6 3350.3 3355.8 6046.0 6383.7 6400.8 6431.2 6446.5 6311.0 6333.5 6335.2 6336.5 6391.3 6207.9 6311.0 6444.4 6470.6 6477.6 6180.8 6188.6 6240.8 6247.2 6255.6 6116.0 6122.4 6123.8 6152.7 6157.9 6156.8 6317.9 6369.6 6384.6 6422.4 4237.5 4250.6 4264.8 4270.6 4273.6 5902.6 6130.4 6156.6 6217.8 6218.4 6055.8 6056.2 6064.1 6069.4 6071.9 6026.5 6043.8 6053.5 6059.3 6076.6 5803.5 6029.0 6033.0 6057.5 6164.1 6216.4 6240.8 6241.8 6244.8 6290.6 5950.9 6059.7 6062.3 6089.5 6097.8 07:46:49 INFO - PROCESS | 24586 | 07:46:49 INFO - PROCESS | 24586 | [#5] yui.html Cycles:180 Average:22701.41 Median:3888.87 stddev:32552.88 (837.1%) stddev-sans-first:32602.88 07:46:49 INFO - PROCESS | 24586 | Values: 858.5 866.5 891.5 914.1 926.2 16718.3 18636.0 18661.0 18714.3 18736.2 16415.4 16611.6 16641.2 16727.7 16806.8 868.8 874.9 887.2 891.9 909.0 892.1 897.8 899.6 899.7 899.8 961.2 961.4 961.7 961.8 961.9 949.2 958.2 958.5 959.3 960.0 700.8 703.0 703.7 704.0 705.4 16438.1 16466.8 16499.3 16511.5 16602.9 14099.7 14322.4 14415.0 14965.9 15098.4 14462.6 14729.9 14805.1 14808.9 15104.5 4668.9 4738.4 4782.9 4816.1 4990.5 86123.0 86169.1 87140.6 91210.0 92914.5 12125.2 12284.3 12688.4 12733.7 12927.8 22947.3 22976.7 23171.8 23172.8 23397.8 9436.3 9466.3 9486.3 9531.6 9818.4 5016.3 5077.3 5114.4 5123.3 5228.7 3755.1 3820.9 3821.1 3877.7 3900.0 646.7 651.4 659.6 670.0 674.8 814.1 825.9 844.6 851.6 870.2 11144.2 11150.9 11444.0 11656.1 11877.6 743.1 821.4 825.3 850.6 854.7 4836.8 5219.4 5302.4 5312.5 5318.7 129715.0 129989.0 130220.0 132291.0 132418.0 92137.0 94456.7 117124.0 117543.0 117723.0 52088.5 60892.7 90738.0 90981.0 92161.0 9729.6 10690.2 10702.7 10873.9 10997.0 53268.0 54031.7 54419.5 54987.7 55262.7 73233.0 81375.6 81844.6 82611.0 83589.0 14266.7 14381.6 14395.2 14524.5 14684.9 15749.7 16037.1 16135.8 16969.7 17544.3 15285.5 15382.5 16291.7 16300.9 16684.8 14510.7 14633.3 15023.2 15271.8 15827.7 14172.9 14581.3 14705.7 14763.5 15075.5 11833.6 12914.5 13012.3 13278.9 13316.5 12897.5 13162.7 13348.2 13507.9 13880.6 07:46:49 INFO - PROCESS | 24586 | -------- Summary: end -------- 07:46:49 INFO - PROCESS | 24586 | 07:46:50 INFO - TEST-INFO | 24586: exit 0 07:46:50 INFO - TEST-OK | dromaeo_css | took 1111393ms 07:46:50 INFO - TEST-START | kraken 07:46:50 INFO - operating with platform_type : linux_ 07:46:50 INFO - Initialising browser for kraken test... 07:46:50 INFO - TEST-INFO | started process 24878 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpIIq_GV/profile http://localhost:55990/getInfo.html) 07:46:54 INFO - PROCESS | 24878 | __metrics Screen width/height:1600/1200 07:46:54 INFO - PROCESS | 24878 | colorDepth:24 07:46:54 INFO - PROCESS | 24878 | Browser inner width/height: 1024/697 07:46:54 INFO - PROCESS | 24878 | __metrics 07:46:55 ERROR - PROCESS | 24878 | JavaScript error: chrome://browser/content/tabbrowser.xml, line 2967: TypeError: this.tabs is undefined 07:46:56 INFO - TEST-INFO | 24878: exit 0 07:46:56 INFO - Browser initialized. 07:46:56 INFO - Running cycle 1/1 for kraken test... 07:46:56 INFO - TEST-INFO | started process 25008 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpIIq_GV/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 07:47:08 INFO - PROCESS | 25008 | RSS: Main: 153661440 07:47:08 INFO - PROCESS | 25008 | 07:47:10 INFO - PROCESS | 25008 | Cycle 1(1): loaded http://localhost:55990/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:55990/tests/kraken/driver.html?testName=audio-beat-detection) 07:47:11 INFO - PROCESS | 25008 | RSS: Main: 158949376 07:47:11 INFO - PROCESS | 25008 | 07:47:13 INFO - PROCESS | 25008 | Cycle 1(1): loaded http://localhost:55990/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:55990/tests/kraken/driver.html?testName=audio-dft) 07:47:14 INFO - PROCESS | 25008 | RSS: Main: 157425664 07:47:14 INFO - PROCESS | 25008 | 07:47:17 INFO - PROCESS | 25008 | Cycle 1(1): loaded http://localhost:55990/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:55990/tests/kraken/driver.html?testName=audio-fft) 07:47:18 INFO - PROCESS | 25008 | RSS: Main: 158314496 07:47:18 INFO - PROCESS | 25008 | 07:47:20 INFO - PROCESS | 25008 | Cycle 1(1): loaded http://localhost:55990/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:55990/tests/kraken/driver.html?testName=audio-oscillator) 07:47:20 INFO - PROCESS | 25008 | RSS: Main: 158015488 07:47:20 INFO - PROCESS | 25008 | 07:47:22 INFO - PROCESS | 25008 | Cycle 1(1): loaded http://localhost:55990/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:55990/tests/kraken/driver.html?testName=imaging-gaussian-blur) 07:47:23 INFO - PROCESS | 25008 | RSS: Main: 157605888 07:47:23 INFO - PROCESS | 25008 | 07:47:26 INFO - PROCESS | 25008 | Cycle 1(1): loaded http://localhost:55990/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:55990/tests/kraken/driver.html?testName=imaging-darkroom) 07:47:27 INFO - PROCESS | 25008 | RSS: Main: 158281728 07:47:27 INFO - PROCESS | 25008 | 07:47:30 INFO - PROCESS | 25008 | Cycle 1(1): loaded http://localhost:55990/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:55990/tests/kraken/driver.html?testName=imaging-desaturate) 07:47:31 INFO - PROCESS | 25008 | RSS: Main: 156233728 07:47:31 INFO - PROCESS | 25008 | 07:47:34 INFO - PROCESS | 25008 | Cycle 1(1): loaded http://localhost:55990/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:55990/tests/kraken/driver.html?testName=json-parse-financial) 07:47:34 INFO - PROCESS | 25008 | RSS: Main: 157528064 07:47:34 INFO - PROCESS | 25008 | 07:47:36 INFO - PROCESS | 25008 | Cycle 1(1): loaded http://localhost:55990/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:55990/tests/kraken/driver.html?testName=json-stringify-tinderbox) 07:47:36 INFO - PROCESS | 25008 | RSS: Main: 157372416 07:47:36 INFO - PROCESS | 25008 | 07:47:38 INFO - PROCESS | 25008 | Cycle 1(1): loaded http://localhost:55990/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:55990/tests/kraken/driver.html?testName=stanford-crypto-aes) 07:47:39 INFO - PROCESS | 25008 | RSS: Main: 157757440 07:47:39 INFO - PROCESS | 25008 | 07:47:41 INFO - PROCESS | 25008 | Cycle 1(1): loaded http://localhost:55990/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:55990/tests/kraken/driver.html?testName=stanford-crypto-ccm) 07:47:42 INFO - PROCESS | 25008 | RSS: Main: 158498816 07:47:42 INFO - PROCESS | 25008 | 07:47:44 INFO - PROCESS | 25008 | Cycle 1(1): loaded http://localhost:55990/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:55990/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 07:47:45 INFO - PROCESS | 25008 | RSS: Main: 158203904 07:47:45 INFO - PROCESS | 25008 | 07:47:47 INFO - PROCESS | 25008 | Cycle 1(1): loaded http://localhost:55990/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:55990/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 07:47:48 INFO - PROCESS | 25008 | RSS: Main: 158330880 07:47:48 INFO - PROCESS | 25008 | 07:47:50 INFO - PROCESS | 25008 | Cycle 1(1): loaded http://localhost:55990/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:55990/tests/kraken/driver.html?testName=ai-astar) 07:47:50 INFO - PROCESS | 25008 | RSS: Main: 160133120 07:47:50 INFO - PROCESS | 25008 | 07:47:50 INFO - PROCESS | 25008 | __start_tp_report 07:47:50 INFO - PROCESS | 25008 | _x_x_mozilla_page_load 07:47:50 INFO - PROCESS | 25008 | _x_x_mozilla_page_load_details 07:47:50 INFO - PROCESS | 25008 | |i|pagename|runs| 07:47:50 INFO - PROCESS | 25008 | |0;ai-astar;101;111;111;106;111;111;111;111;110;121 07:47:50 INFO - PROCESS | 25008 | |1;audio-beat-detection;144;117;145;174;118;148;149;116;174;118 07:47:50 INFO - PROCESS | 25008 | |2;audio-dft;163;163;162;175;162;163;164;163;162;162 07:47:50 INFO - PROCESS | 25008 | |3;audio-fft;74;76;76;184;78;75;75;76;163;75 07:47:50 INFO - PROCESS | 25008 | |4;audio-oscillator;84;85;147;85;85;87;141;84;84;142 07:47:50 INFO - PROCESS | 25008 | |5;imaging-gaussian-blur;118;117;117;117;117;118;120;121;116;117 07:47:50 INFO - PROCESS | 25008 | |6;imaging-darkroom;148;148;147;148;149;147;147;149;147;148 07:47:50 INFO - PROCESS | 25008 | |7;imaging-desaturate;96;96;97;96;95;95;96;96;96;96 07:47:50 INFO - PROCESS | 25008 | |8;json-parse-financial;51;52;51;52;52;51;55;54;51;51 07:47:50 INFO - PROCESS | 25008 | |9;json-stringify-tinderbox;60;60;61;60;61;60;61;60;60;61 07:47:50 INFO - PROCESS | 25008 | |10;stanford-crypto-aes;72;72;72;82;71;73;72;73;74;73 07:47:50 INFO - PROCESS | 25008 | |11;stanford-crypto-ccm;119;117;135;119;122;117;118;122;154;118 07:47:50 INFO - PROCESS | 25008 | |12;stanford-crypto-pbkdf2;156;152;153;157;159;163;160;153;164;154 07:47:50 INFO - PROCESS | 25008 | |13;stanford-crypto-sha256-iterative;62;68;63;62;62;65;61;61;63;65 07:47:50 INFO - PROCESS | 25008 | __end_tp_report 07:47:50 INFO - PROCESS | 25008 | __start_cc_report 07:47:50 INFO - PROCESS | 25008 | _x_x_mozilla_cycle_collect,864 07:47:50 INFO - PROCESS | 25008 | __end_cc_report 07:47:50 INFO - PROCESS | 25008 | __startTimestamp1474123670355__endTimestamp 07:47:50 INFO - PROCESS | 25008 | 07:47:50 INFO - PROCESS | 25008 | ------- Summary: start ------- 07:47:50 INFO - PROCESS | 25008 | Number of tests: 14 07:47:50 INFO - PROCESS | 25008 | 07:47:50 INFO - PROCESS | 25008 | [#0] ai-astar Cycles:10 Average:110.40 Median:111.00 stddev:4.97 (4.5%) stddev-sans-first:3.94 07:47:50 INFO - PROCESS | 25008 | Values: 101.0 111.0 111.0 106.0 111.0 111.0 111.0 111.0 110.0 121.0 07:47:50 INFO - PROCESS | 25008 | 07:47:50 INFO - PROCESS | 25008 | [#1] audio-beat-detection Cycles:10 Average:140.30 Median:146.50 stddev:22.53 (15.4%) stddev-sans-first:23.86 07:47:50 INFO - PROCESS | 25008 | Values: 144.0 117.0 145.0 174.0 118.0 148.0 149.0 116.0 174.0 118.0 07:47:50 INFO - PROCESS | 25008 | 07:47:50 INFO - PROCESS | 25008 | [#2] audio-dft Cycles:10 Average:163.90 Median:163.00 stddev:3.96 (2.4%) stddev-sans-first:4.18 07:47:50 INFO - PROCESS | 25008 | Values: 163.0 163.0 162.0 175.0 162.0 163.0 164.0 163.0 162.0 162.0 07:47:50 INFO - PROCESS | 25008 | 07:47:50 INFO - PROCESS | 25008 | [#3] audio-fft Cycles:10 Average:95.20 Median:75.50 stddev:41.58 (55.1%) stddev-sans-first:43.39 07:47:50 INFO - PROCESS | 25008 | Values: 74.0 76.0 76.0 184.0 78.0 75.0 75.0 76.0 163.0 75.0 07:47:50 INFO - PROCESS | 25008 | 07:47:50 INFO - PROCESS | 25008 | [#4] audio-oscillator Cycles:10 Average:102.40 Median:84.50 stddev:28.30 (33.5%) stddev-sans-first:29.22 07:47:50 INFO - PROCESS | 25008 | Values: 84.0 85.0 147.0 85.0 85.0 87.0 141.0 84.0 84.0 142.0 07:47:50 INFO - PROCESS | 25008 | 07:47:50 INFO - PROCESS | 25008 | [#5] imaging-gaussian-blur Cycles:10 Average:117.80 Median:117.50 stddev:1.55 (1.3%) stddev-sans-first:1.64 07:47:50 INFO - PROCESS | 25008 | Values: 118.0 117.0 117.0 117.0 117.0 118.0 120.0 121.0 116.0 117.0 07:47:50 INFO - PROCESS | 25008 | 07:47:50 INFO - PROCESS | 25008 | [#6] imaging-darkroom Cycles:10 Average:147.80 Median:148.00 stddev:0.79 (0.5%) stddev-sans-first:0.83 07:47:50 INFO - PROCESS | 25008 | Values: 148.0 148.0 147.0 148.0 149.0 147.0 147.0 149.0 147.0 148.0 07:47:50 INFO - PROCESS | 25008 | 07:47:50 INFO - PROCESS | 25008 | [#7] imaging-desaturate Cycles:10 Average:95.90 Median:96.00 stddev:0.57 (0.6%) stddev-sans-first:0.60 07:47:50 INFO - PROCESS | 25008 | Values: 96.0 96.0 97.0 96.0 95.0 95.0 96.0 96.0 96.0 96.0 07:47:50 INFO - PROCESS | 25008 | 07:47:50 INFO - PROCESS | 25008 | [#8] json-parse-financial Cycles:10 Average:52.00 Median:52.00 stddev:1.41 (2.7%) stddev-sans-first:1.45 07:47:50 INFO - PROCESS | 25008 | Values: 51.0 52.0 51.0 52.0 52.0 51.0 55.0 54.0 51.0 51.0 07:47:50 INFO - PROCESS | 25008 | 07:47:50 INFO - PROCESS | 25008 | [#9] json-stringify-tinderbox Cycles:10 Average:60.40 Median:60.50 stddev:0.52 (0.9%) stddev-sans-first:0.53 07:47:50 INFO - PROCESS | 25008 | Values: 60.0 60.0 61.0 60.0 61.0 60.0 61.0 60.0 60.0 61.0 07:47:50 INFO - PROCESS | 25008 | 07:47:50 INFO - PROCESS | 25008 | [#10] stanford-crypto-aes Cycles:10 Average:73.40 Median:73.00 stddev:3.13 (4.3%) stddev-sans-first:3.28 07:47:50 INFO - PROCESS | 25008 | Values: 72.0 72.0 72.0 82.0 71.0 73.0 72.0 73.0 74.0 73.0 07:47:50 INFO - PROCESS | 25008 | 07:47:50 INFO - PROCESS | 25008 | [#11] stanford-crypto-ccm Cycles:10 Average:124.10 Median:120.50 stddev:11.78 (9.8%) stddev-sans-first:12.35 07:47:50 INFO - PROCESS | 25008 | Values: 119.0 117.0 135.0 119.0 122.0 117.0 118.0 122.0 154.0 118.0 07:47:50 INFO - PROCESS | 25008 | 07:47:50 INFO - PROCESS | 25008 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:157.10 Median:158.00 stddev:4.28 (2.7%) stddev-sans-first:4.52 07:47:50 INFO - PROCESS | 25008 | Values: 156.0 152.0 153.0 157.0 159.0 163.0 160.0 153.0 164.0 154.0 07:47:50 INFO - PROCESS | 25008 | 07:47:50 INFO - PROCESS | 25008 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:63.20 Median:63.00 stddev:2.20 (3.5%) stddev-sans-first:2.29 07:47:50 INFO - PROCESS | 25008 | Values: 62.0 68.0 63.0 62.0 62.0 65.0 61.0 61.0 63.0 65.0 07:47:50 INFO - PROCESS | 25008 | -------- Summary: end -------- 07:47:50 INFO - PROCESS | 25008 | 07:47:51 INFO - TEST-INFO | 25008: exit 0 07:47:51 INFO - TEST-OK | kraken | took 60959ms 07:47:51 INFO - SUITE-END | took 1172s 07:47:51 INFO - Completed test suite (00:19:32) 07:47:51 INFO - javascript benchmark 07:47:51 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"extraOptions": ["e10s"], "name": "dromaeo_css", "lowerIsBetter": false, "alertThreshold": 5.0, "value": 7793.967543457466, "subtests": [{"name": "dojo.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [3270.231495598534, 3295.8187299698507, 3304.273059926816, 3309.6524864889184, 3324.3517514084765, 5736.082226843706, 5743.856403589913, 5806.564507661927, 5811.128330750379, 5819.9127013094785, 5708.457696518824, 5781.364049954502, 5783.074708046714, 5798.5361171106315, 5836.445537673925, 5199.038177937085, 5264.578833693296, 5284.101702710529, 5311.044012077825, 5339.092354299778, 5110.923336149942, 5194.662346947455, 5195.038917800201, 5217.165253559431, 5241.79032838686, 5193.45468725784, 5224.39919409269, 5243.554297884684, 5254.343207099113, 5297.602679799012, 5289.576833853283, 5296.788128474856, 5308.522232999048, 5310.0, 5319.042572336978, 5110.054639891595, 5154.304168937183, 5163.457836927106, 5199.272101905736, 5211.166213405837, 5708.372079071299, 5732.742026608813, 5756.769729210869, 5764.394738552433, 5804.216430781833, 6182.443580077769, 6190.783322583733, 6231.127642130105, 6232.40792124752, 6262.812115636538, 5977.641341519479, 6129.233845769279, 6144.5698801083945, 6286.968565157145, 6296.496280297565, 5785.479306862402, 5800.5939584229545, 5803.53571714266, 5805.970970145165, 5837.64974101551, 6320.5575609706875, 6346.650934198663, 6358.523110766711, 6366.490680745529, 6377.553571249968, 5988.730507127189, 6010.549208809357, 6035.426634469718, 6111.419415155553, 6113.724882380304, 6193.535484838565, 6238.157848690459, 6243.656598887014, 6250.812345654311, 6254.312025677263, 6197.96901015492, 6209.627422354673, 6215.12988181655, 6227.1282020517165, 6238.313785483593, 5967.6121052131475, 6114.755409783648, 6137.193127861533, 6159.4456498915315, 6173.32093469718, 4772.069446457907, 4773.093112308719, 4774.570288674036, 4782.210935195653, 4801.423829140455, 4239.872803815891, 4244.915101697949, 4251.319788833772, 4253.04306531028, 4272.359146128106, 5757.712114394263, 5916.467517923407, 5924.229850119543, 6029.78895738647, 6057.061155520902, 6252.937470625327, 6267.968660156761, 6299.401556852092, 6301.243850737941, 6302.306746257908, 5969.432903874125, 6020.127081573148, 6021.548383871227, 6032.668203248863, 6063.818085457443, 5055.7219352935945, 5068.315777370081, 5089.414717307557, 5186.118359878829, 5197.948020519822, 6365.204349456318, 6403.263624683128, 6416.390442907917, 6416.486681065504, 6423.454006409414, 6141.048137538689, 6149.631022138686, 6172.074188871705, 6198.938010619926, 6216.595921265284, 6156.507479401547, 6298.212723409574, 6365.745370185141, 6400.39196276353, 6431.163948686828, 6115.209918062711, 6148.354422785543, 6163.784267550794, 6164.4143806338325, 6178.66017369031, 6281.842953926189, 6292.370762923671, 6293.181886354744, 6293.496520278458, 6293.779717710041, 5933.228680271537, 5935.673537955454, 5982.0, 6039.0, 6113.5414843886, 6003.7898673546215, 6016.398360163948, 6018.307894592178, 6022.969885150546, 6048.788292409745, 6000.969995149996, 6008.519318454426, 6056.485198758155, 6056.6971651418135, 6067.605605635797, 5923.466887980103, 6036.0644100164545, 6047.848803779941, 6073.453389194994, 6075.2405949256345, 5919.940800591939, 5981.1327357532045, 5982.910256346246, 6003.6397816131175, 6008.909866351921], "value": 5705.183895064143, "unit": "score"}, {"name": "ext.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [576.3947854752508, 627.9560430769848, 645.1999520594463, 654.1986067067843, 655.3217419970332, 41640.16719665609, 46215.07569848601, 46286.07427851441, 46352.0, 46387.53612463874, 45778.77110614442, 45791.542084579225, 46098.53901460993, 46222.30666540004, 46397.7680111599, 8981.461112333282, 9155.954220228923, 9200.0, 9212.585433655502, 9213.493257870814, 9133.132352426508, 9222.492762898039, 9223.723288301362, 9226.400283981553, 9239.307051971095, 9135.36052476327, 9237.12247336502, 9266.953665231664, 9271.675491357804, 9287.860682089775, 9184.403013804114, 9226.031266716998, 9250.398724082947, 9276.11876871696, 9294.117058879396, 9106.590203440861, 9181.954090229507, 9207.493587852665, 9208.401453905475, 9251.167394934488, 36385.27229455396, 36857.26285474302, 36873.262534749425, 36911.44632830509, 36929.815350923076, 4036.091879327128, 4054.7161698681102, 4133.627973482371, 4159.334506478979, 4218.641415479688, 34180.82909585461, 34371.65628343709, 34717.0, 34776.30447391063, 35784.46323305152, 4706.3411122442885, 4711.552402521755, 4718.103560323528, 4737.786799593992, 4811.0, 362473.0, 363356.0, 365134.0, 365453.1727341373, 366759.0, 60416.69791651014, 60879.39120608826, 61083.6945815277, 61217.0, 61563.384366156664, 39567.40648890269, 40200.59799402027, 40640.39039414411, 41823.58176418258, 41984.79007604942, 19238.0, 19262.518437039187, 19286.903565482364, 19367.12847921847, 19411.320603779084, 14889.0, 14920.477783277533, 14938.775918361232, 15024.924875375553, 15035.398584056515, 20575.0, 20785.1685932561, 20917.686234706493, 20940.47648808792, 20984.160633574793, 7529.661165247577, 7597.5821329826285, 7777.805554861061, 7782.638038343381, 7911.84176316482, 1052.6000119954522, 1102.5204036244259, 1117.9105671546256, 1118.4743170709753, 1128.1087940527057, 33997.32005359879, 34810.825945870616, 34965.825170873984, 35146.64853351434, 35186.47220291698, 1139.9031082357926, 1150.3040660400504, 1209.564556759566, 1215.665691934725, 1232.89520390766, 16824.663506729798, 17237.28813559322, 17324.65350692979, 17469.21388537519, 17794.822051779316, 456583.0, 642561.0, 648878.0, 650013.0, 880719.0, 65036.674816625615, 66225.0, 66287.33712662908, 66310.33689663139, 66326.33673663298, 1474.506040476431, 1489.7690857917041, 1504.247876061969, 1508.7058023685277, 1535.554689140159, 34239.315213696085, 35024.0, 35127.29745405129, 35239.295214096084, 35437.64562354344, 55444.72277638586, 55709.0, 55916.72041639766, 56106.438935610124, 56240.0, 529080.0, 530164.0, 531040.0, 531459.0, 531751.0, 31562.526562102044, 31774.841125794224, 32230.516542252353, 32330.83834580906, 32396.838015810714, 51474.0, 51589.48410515997, 51898.48101518936, 52434.47565524449, 52912.735436322575, 44245.336319954586, 44661.55338446574, 44926.0, 45420.772896135306, 46309.53690463052, 42487.3626895603, 42661.78669106634, 43609.56390436182, 44322.55677443184, 44595.0, 43941.78029109834, 44125.55874441215, 45139.645810625734, 45495.31757023714, 45742.313865291384, 37551.0, 39758.403623946244, 39811.60188398195, 39827.0, 40348.0, 29786.851065744533, 30107.69892301049, 30381.696183037886, 30977.535336970413, 31047.0], "value": 21465.748304388668, "unit": "score"}, {"name": "jquery.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [390.88468901673986, 395.6379912380172, 424.64542107340367, 430.63180980261876, 431.0753433884318, 19177.52056198594, 20174.39476815694, 20557.691634625473, 21111.366659000236, 21130.260440884573, 19728.21087156512, 19763.407097787054, 19815.900920495413, 20374.0, 20525.384238472834, 5639.661620302774, 5815.82552523425, 5854.238948936632, 5861.267341582302, 5867.119932010211, 5785.334686511042, 5786.56600754943, 5827.213326200972, 5870.970645146768, 5942.5840191186635, 5865.706714664271, 5883.29400471944, 5886.323072846634, 5940.138679891413, 5942.257217847769, 5753.741081651315, 5791.623544469617, 5836.854078648025, 5887.558433117533, 5904.350521442638, 5101.846944591668, 5224.686518808846, 5231.163013917755, 5232.686038837682, 5235.921461178047, 24296.392590185387, 24614.753852461425, 24636.630450543256, 25069.37326566832, 25194.0, 2595.779358754508, 2625.842449453039, 2788.261110805638, 2876.7267109624554, 2900.666423361319, 7644.312011918954, 7791.181925897812, 11808.704782380424, 15564.0, 15993.920030399773, 1882.1342182596022, 1923.7005293169755, 1940.7865134835156, 1978.3669225847734, 1987.3243097346972, 67175.3282467174, 85137.0, 87018.12981870226, 87499.56250218708, 87564.56217718935, 11086.501107450184, 11122.110231181487, 11378.374189419495, 11518.675352334589, 11598.652040438632, 16088.195590220676, 16243.918780406022, 16267.59331016734, 16272.430464933906, 16314.34742610306, 8377.916220837713, 8468.153184681483, 8524.488530688179, 8527.104654011364, 8656.047834738174, 8267.0, 8283.130271321545, 8378.958105209556, 8396.580170991427, 8427.41008129425, 7068.929310706827, 7128.895021271711, 7163.140423149255, 7174.713011479483, 7190.892136617955, 2023.3626407681827, 2086.3636590839938, 2124.776898425674, 2133.423975526599, 2145.8712477251415, 1048.528162326956, 1069.3476979042778, 1110.1784679337231, 1114.2868564118971, 1132.7111586545377, 21275.680864787042, 21452.24917127893, 21502.677459838116, 21585.136594536358, 21621.13515459364, 1088.542812018954, 1115.0856297835696, 1155.2894969593808, 1176.300101439642, 1183.402381797187, 12000.0, 12050.457729402198, 12137.5144994201, 12150.5139794409, 12209.023278137727, 477587.0, 478469.0, 495537.0, 543481.0, 545191.0, 82737.0, 85198.0, 85470.57264713636, 87451.0, 88838.0, 1100.878903320634, 1121.5738019552518, 1126.2679258482053, 1129.4635048351968, 1137.3176094343328, 17921.910390447963, 18919.0, 18999.810001900358, 19060.523486912938, 19114.0, 40396.0, 41731.0, 42477.362839556816, 42700.7189784307, 42770.0, 54768.45231547634, 56014.439855600926, 56030.0, 56169.43830561805, 56846.7157664209, 7910.2089791020435, 8192.795180120545, 8224.465409748347, 8498.431730654615, 9478.38390504615, 12403.875961240272, 13845.51540696111, 13923.164610123426, 14660.193689347188, 14688.779668305198, 12810.295433751233, 12813.295268760308, 12896.8065479016, 13078.934605326913, 13111.2133272004, 12249.632511024683, 12451.377431128227, 12479.500819967463, 12504.249745015328, 12576.87423125757, 12285.262884226975, 12626.747465050832, 12697.42861571213, 12702.6027137013, 13095.148815326973, 7911.248431399008, 8372.120927302545, 8387.035490918623, 8502.659893604186, 8871.822563548563, 5641.0, 9442.622295108393, 12229.816552751894, 12274.140810143204, 12385.071119665881], "value": 9743.104734854634, "unit": "score"}, {"name": "mootools.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [1541.7918580991566, 1565.9921700391496, 1709.9658006839857, 1835.9449216523492, 1858.6096919646873, 8344.582770861447, 8883.333749968746, 8966.730998070052, 9746.902530974688, 9755.609775608986, 8960.462372257669, 9291.070892910706, 9330.626774928995, 9339.3462457628, 9340.906590934088, 2481.0323973650334, 2510.8493490390542, 2514.170323793153, 2515.4969006198835, 2516.169664010881, 2421.1889017179265, 2483.50329934013, 2502.27434044127, 2505.8496490210646, 2515.811314151437, 2451.105346548506, 2476.7523247675267, 2520.6849143857016, 2525.103588226181, 2532.012515119105, 2380.27401642499, 2394.7006624171977, 2401.9279421617466, 2408.3617841272076, 2420.649005894153, 2401.519696060795, 2409.8915548800346, 2427.3446169534127, 2436.988649710368, 2451.0, 9243.76890577741, 9291.024442433514, 9296.070392960717, 9338.159565639056, 9346.15884570392, 5432.809851655173, 5529.0, 5541.307336582927, 5562.916556251659, 5571.1086226203615, 3473.409520381516, 3539.752217344787, 3604.891853244407, 3685.0, 3686.8525258989607, 1193.4271549656128, 1194.2058531076823, 1196.0491409329604, 1223.62067758995, 1234.6481252842896, 13445.462181512825, 13448.731025379535, 13504.0, 13516.256605886672, 13584.660383490393, 4825.662203645781, 4909.975450122726, 4936.185529387682, 4948.579370753454, 5130.948690513047, 11138.108951283877, 11211.831822522669, 11217.0, 11227.157963152797, 11246.66260012201, 5548.334199896039, 5557.888842223214, 5562.916556251659, 5575.135853942646, 5605.7197140142825, 4652.185867473178, 5027.79888804451, 5110.693358398508, 5174.560162386164, 5190.377154741455, 4354.608085272277, 4380.102079073782, 4451.844185453494, 4456.598906098467, 4485.842995495207, 1378.2144177818548, 1387.5767890793204, 1387.6877702516854, 1390.8719658921664, 1433.5269361111018, 987.4223579206244, 988.658912675126, 1010.2776514791813, 1010.4594042187395, 1046.2937517175876, 5896.321922978912, 5971.79098731551, 6017.247844019497, 6024.548158888013, 6167.136600875881, 485.09287632128144, 485.9149648811444, 490.5707505932309, 493.1640868727544, 494.7921872813427, 4153.439285696392, 4184.639992002551, 4254.957450425518, 4303.720258183208, 4364.759938203366, 11296.0, 11551.249168804, 11804.822927656092, 11849.111316651286, 11893.583724569771, 11658.6502404928, 11667.42489763871, 11677.35774532392, 11704.765904681859, 11707.765844683228, 8237.83524329522, 8614.82770344602, 8669.566521673765, 8866.069062748318, 9003.729888103368, 6293.96853015732, 6335.334789847, 6390.297067322498, 6434.324395938546, 6634.601923884582, 10327.638532651321, 10437.373757574569, 10632.946835265775, 10642.627508037182, 10666.73333166677, 10795.676129716121, 10825.350478971286, 10892.727681808019, 10923.672289831318, 11142.554297827995, 8150.9184908150155, 8175.918240817516, 8249.340052795882, 8302.377321701017, 8307.83384332322, 8931.821363572823, 8949.194572488508, 8993.055729148346, 9071.319651026331, 9078.31912606544, 7947.086085100287, 7948.642311095899, 8050.476719013245, 8058.194180581895, 8150.877736834071, 7977.920220797718, 7993.280604745601, 7997.7600671979935, 8050.919490805251, 8153.714619988272, 7400.592967386845, 7425.183229844604, 7461.776146715607, 7466.440016998856, 7546.2831031051965, 5502.669839809624, 5508.14623733322, 5546.585620666704, 5610.747516361856, 5670.574706897081, 5441.591880609049, 5580.0, 5588.161775733673, 5634.971825140848, 5644.322681278273], "value": 4844.311512754339, "unit": "score"}, {"name": "prototype.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [314.38537658876896, 318.4193741378202, 320.88127392864635, 329.6341061421823, 330.47619523055954, 5837.416258374161, 5860.179574859518, 5881.647101173932, 5887.617304875191, 5913.2017177681055, 5746.1668058131545, 5751.166080918264, 5768.567357448198, 5789.652620842752, 5795.4784069433745, 4248.447701798762, 4331.978340108295, 4447.444069491314, 4491.146682130401, 4499.145162419146, 4445.39987101742, 4480.327950807388, 4497.955020449803, 4506.8873278167985, 4524.45706515217, 4460.397846290758, 4462.482755863006, 4465.575770301816, 4496.550344965493, 4505.760915748163, 4334.97832510837, 4462.397576327203, 4482.753448560328, 4491.865244042684, 4494.640428765691, 3950.6839452843706, 3957.168994511156, 3958.940615890764, 3966.365381538969, 3973.1127714335457, 5610.523105536035, 5631.746571404296, 5635.492805647511, 5647.8588035299035, 5654.46282603152, 4976.477469865648, 5108.591312694975, 5109.284700141983, 5133.666311689728, 5151.381834179885, 5973.462388385066, 5995.0, 6002.628961560203, 6013.458788708994, 6021.397860213988, 4254.787260636956, 4297.914041719148, 4298.097399546068, 4301.161273551658, 4348.673849461272, 6272.843178920518, 6311.747530098836, 6315.431611154972, 6315.8526101125835, 6317.715702793339, 4416.293393057095, 4425.446819147606, 4435.491932742883, 4435.955640443619, 4455.6658250631335, 4095.795210239476, 4458.71018383804, 4487.528809475023, 4493.281075028045, 4494.943688233263, 4977.65156439053, 5012.273220383097, 5014.89970200594, 5028.748562571856, 5039.748012599355, 6103.328633850273, 6134.2332208473945, 6151.9234134026365, 6153.753849845956, 6161.537884658668, 1482.561310604033, 1491.7613181890845, 1500.4598344595936, 1507.5025241670223, 1514.5834895403852, 926.0693003531408, 930.1953809954341, 958.9499498049624, 988.7874107067015, 1002.3584905660383, 5835.912461313083, 5840.386759390288, 5841.94158058414, 5848.239728835224, 5910.202122713465, 6171.068742347439, 6191.226096737908, 6231.719572619152, 6231.813045608548, 6235.594686345373, 5738.68437235956, 5892.941070589325, 5905.202797622352, 5907.075997381238, 5915.1718759373725, 3322.767406281537, 3324.1357247115925, 3338.5659864217982, 3350.3131857969547, 3355.765096443274, 6046.007226422861, 6383.680815959184, 6400.839979000562, 6431.228252609717, 6446.484281257488, 6310.968445157745, 6333.524985626096, 6335.176427064452, 6336.510919933812, 6391.265004524446, 6207.937920620826, 6310.968445157745, 6444.421116826314, 6470.611763294123, 6477.578957367756, 6180.7527698891545, 6188.566800323934, 6240.7503699851495, 6247.219097612799, 6255.593386429868, 6115.969420152871, 6122.357152498924, 6123.805857857853, 6152.7390483044055, 6157.89157951573, 6156.846078848064, 6317.873642527032, 6369.598688288569, 6384.6169229846355, 6422.3577642235405, 4237.512686041021, 4250.638695710775, 4264.786760662017, 4270.615644592001, 4273.615374616299, 5902.61632993854, 6130.417610327012, 6156.630602163885, 6217.813465596039, 6218.409251121137, 6055.757769689163, 6056.152138700673, 6064.06007068905, 6069.423404776539, 6071.878562428815, 6026.523501742101, 6043.791241751579, 6053.455189032832, 6059.3334733178435, 6076.605020673642, 5803.47768700819, 6028.950156946659, 6032.974394353058, 6057.454829065406, 6164.137020817179, 6216.409441103269, 6240.7503699851495, 6241.78153764616, 6244.843878903063, 6290.622562646256, 5950.880982380415, 6059.666718330534, 6062.302835174011, 6089.512838972783, 6097.817065487865], "value": 4590.153139879207, "unit": "score"}, {"name": "yui.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [858.4591707224448, 866.4801119328407, 891.482939894861, 914.0996118822962, 926.1525703980856, 16718.33126674933, 18636.0, 18661.0, 18714.344997925076, 18736.156872940715, 16415.425460108898, 16611.584710382216, 16641.1679416029, 16727.66544669106, 16806.83193168068, 868.8392647360258, 874.8556488179443, 887.2148148888248, 891.8751374807499, 908.9818203635956, 892.0633334998258, 897.7531178925815, 899.5637115998768, 899.7075950316141, 899.8110396816676, 961.2454223434605, 961.403929563668, 961.7403301108732, 961.7691753979065, 961.9278554108434, 949.1931857920781, 958.1855422890523, 958.4967891856761, 959.2853324273461, 960.0207788056143, 700.8037749430167, 703.0263085626393, 703.6938931564786, 703.968321425537, 705.4250785609712, 16438.095904725236, 16466.75299870503, 16499.257533410906, 16511.504654860375, 16602.916985414995, 14099.71800563983, 14322.355494002795, 14415.0, 14965.850341496664, 15098.396064157421, 14462.566123016326, 14729.852701472955, 14805.111693298437, 14808.925955370261, 15104.471343503035, 4668.906621867543, 4738.384010078702, 4782.856514304542, 4816.109019831342, 4990.451050384455, 86123.0, 86169.13830861673, 87140.56429717875, 91210.0, 92914.53542732244, 12125.151239413157, 12284.324362160167, 12688.429020694091, 12733.745325093447, 12927.806082908764, 22947.311580652608, 22976.655350169425, 23171.76828231696, 23172.768272317397, 23397.7660223399, 9436.292278079172, 9466.29002824791, 9486.288528360401, 9531.571079301448, 9818.410895346302, 5016.297718319365, 5077.31456253401, 5114.360704911886, 5123.308353372247, 5228.712420816892, 3755.117547376364, 3820.9235815284096, 3821.121142137324, 3877.689784817208, 3900.0444891001885, 646.741303478603, 651.4104735214638, 659.5745743995096, 669.9765508207189, 674.7672053141658, 814.0882211922566, 825.8885050518103, 844.6452489954233, 851.5742128935532, 870.2168048756043, 11144.2199046066, 11150.888491114985, 11444.0, 11656.125790565571, 11877.643670689893, 743.1008479739468, 821.3798582070499, 825.3149885594942, 850.6427300533791, 854.7222152800365, 4836.758162091952, 5219.42586315505, 5302.416734159239, 5312.495312945264, 5318.654287471302, 129715.0, 129989.0, 130220.0, 132291.0, 132418.0, 92137.0, 94456.69401570912, 117124.0, 117543.0, 117723.0, 52088.47911520836, 60892.695536522035, 90738.0, 90981.0, 92161.0, 9729.610815567581, 10690.198235132551, 10702.678919632424, 10873.945630271797, 10997.0, 53268.0, 54031.72984135054, 54419.45580544144, 54987.72506137444, 55262.72368638292, 73233.0, 81375.59312203401, 81844.59077704573, 82611.0, 83589.0, 14266.71466570642, 14381.568552943429, 14395.208263545606, 14524.49164279245, 14684.85315146835, 15749.685006300038, 16037.117958512394, 16135.838641613904, 16969.660606788042, 17544.298228070733, 15285.465008724641, 15382.538523844303, 16291.674166516841, 16300.918495407921, 16684.833151668812, 14510.709785804436, 14633.268336583342, 15023.248837558296, 15271.847281527043, 15827.683446331239, 14172.929135354258, 14581.270936453348, 14705.70588588201, 14763.483278085216, 15075.472358467401, 11833.585824496446, 12914.483420663444, 13012.284324361872, 13278.86721132815, 13316.533921312708, 12897.548585799452, 13162.670933226746, 13348.199108053159, 13507.932460337635, 13880.583582492542], "value": 8447.671284277354, "unit": "score"}]}, {"extraOptions": ["e10s"], "name": "kraken", "lowerIsBetter": true, "alertThreshold": 2.0, "value": 1503.8999999999999, "subtests": [{"name": "ai-astar", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [101.0, 111.0, 111.0, 106.0, 111.0, 111.0, 111.0, 111.0, 110.0, 121.0], "value": 110.4, "unit": "score"}, {"name": "audio-beat-detection", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [144.0, 117.0, 145.0, 174.0, 118.0, 148.0, 149.0, 116.0, 174.0, 118.0], "value": 140.3, "unit": "score"}, {"name": "audio-dft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [163.0, 163.0, 162.0, 175.0, 162.0, 163.0, 164.0, 163.0, 162.0, 162.0], "value": 163.9, "unit": "score"}, {"name": "audio-fft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [74.0, 76.0, 76.0, 184.0, 78.0, 75.0, 75.0, 76.0, 163.0, 75.0], "value": 95.2, "unit": "score"}, {"name": "audio-oscillator", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [84.0, 85.0, 147.0, 85.0, 85.0, 87.0, 141.0, 84.0, 84.0, 142.0], "value": 102.4, "unit": "score"}, {"name": "imaging-gaussian-blur", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [118.0, 117.0, 117.0, 117.0, 117.0, 118.0, 120.0, 121.0, 116.0, 117.0], "value": 117.8, "unit": "score"}, {"name": "imaging-darkroom", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [148.0, 148.0, 147.0, 148.0, 149.0, 147.0, 147.0, 149.0, 147.0, 148.0], "value": 147.8, "unit": "score"}, {"name": "imaging-desaturate", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [96.0, 96.0, 97.0, 96.0, 95.0, 95.0, 96.0, 96.0, 96.0, 96.0], "value": 95.9, "unit": "score"}, {"name": "json-parse-financial", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [51.0, 52.0, 51.0, 52.0, 52.0, 51.0, 55.0, 54.0, 51.0, 51.0], "value": 52.0, "unit": "score"}, {"name": "json-stringify-tinderbox", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [60.0, 60.0, 61.0, 60.0, 61.0, 60.0, 61.0, 60.0, 60.0, 61.0], "value": 60.4, "unit": "score"}, {"name": "stanford-crypto-aes", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [72.0, 72.0, 72.0, 82.0, 71.0, 73.0, 72.0, 73.0, 74.0, 73.0], "value": 73.4, "unit": "score"}, {"name": "stanford-crypto-ccm", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [119.0, 117.0, 135.0, 119.0, 122.0, 117.0, 118.0, 122.0, 154.0, 118.0], "value": 124.1, "unit": "score"}, {"name": "stanford-crypto-pbkdf2", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [156.0, 152.0, 153.0, 157.0, 159.0, 163.0, 160.0, 153.0, 164.0, 154.0], "value": 157.1, "unit": "score"}, {"name": "stanford-crypto-sha256-iterative", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [62.0, 68.0, 63.0, 62.0, 62.0, 65.0, 61.0, 61.0, 63.0, 65.0], "value": 63.2, "unit": "score"}]}]} 07:47:51 INFO - Return code: 0 07:47:51 INFO - Validating PERFHERDER_DATA against /builds/slave/test/scripts/external_tools/performance-artifact-schema.json 07:47:51 ERROR - # TBPL SUCCESS # 07:47:51 INFO - Running post-action listener: _resource_record_post_action 07:47:51 INFO - [mozharness: 2016-09-17 14:47:51.665663Z] Finished run-tests step (success) 07:47:51 INFO - Running post-run listener: _resource_record_post_run 07:47:51 INFO - Total resource usage - Wall time: 1190s; CPU: 13.0%; Read bytes: 593920; Write bytes: 328540160; Read time: 796; Write time: 282840 07:47:51 INFO - TinderboxPrint: CPU usage
13.2% 07:47:51 INFO - TinderboxPrint: I/O read bytes / time
593,920 / 796 07:47:51 INFO - TinderboxPrint: I/O write bytes / time
328,540,160 / 282,840 07:47:51 INFO - TinderboxPrint: CPU idle
8,237.5 (86.8%) 07:47:51 INFO - TinderboxPrint: CPU user
1,198.1 (12.6%) 07:47:51 INFO - TinderboxPrint: Swap in / out
0 / 0 07:47:51 INFO - install - Wall time: 17s; CPU: 13.0%; Read bytes: 0; Write bytes: 77467648; Read time: 0; Write time: 60516 07:47:51 INFO - run-tests - Wall time: 1173s; CPU: 13.0%; Read bytes: 589824; Write bytes: 248647680; Read time: 768; Write time: 222080 07:47:52 INFO - Running post-run listener: _upload_blobber_files 07:47:52 INFO - Blob upload gear active. 07:47:52 INFO - Preparing to upload files from /builds/slave/test/build/blobber_upload_dir. 07:47:52 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 07:47:52 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/venv/bin/blobberc.py', '-u', 'https://blobupload.elasticbeanstalk.com', '-a', '/builds/slave/test/oauth.txt', '-b', 'Mozilla-Aurora', '-d', '/builds/slave/test/build/blobber_upload_dir', '--output-manifest', '/builds/slave/test/build/uploaded_files.json'] 07:47:52 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/venv/bin/blobberc.py -u https://blobupload.elasticbeanstalk.com -a /builds/slave/test/oauth.txt -b Mozilla-Aurora -d /builds/slave/test/build/blobber_upload_dir --output-manifest /builds/slave/test/build/uploaded_files.json 07:47:52 INFO - (blobuploader) - INFO - Open directory for files ... 07:47:52 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/resource-usage.json ... 07:47:52 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 07:47:52 INFO - (blobuploader) - INFO - Uploading, attempt #1. 07:47:56 INFO - (blobuploader) - INFO - TinderboxPrint: resource-usage.json: uploaded 07:47:56 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 07:47:56 INFO - (blobuploader) - INFO - Done attempting. 07:47:56 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log ... 07:47:56 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 07:47:56 INFO - (blobuploader) - INFO - Uploading, attempt #1. 07:47:56 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_raw.log: uploaded 07:47:56 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 07:47:56 INFO - (blobuploader) - INFO - Done attempting. 07:47:56 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log ... 07:47:56 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 07:47:56 INFO - (blobuploader) - INFO - Uploading, attempt #1. 07:47:57 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_errorsummary.log: uploaded 07:47:57 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 07:47:57 INFO - (blobuploader) - INFO - Done attempting. 07:47:57 INFO - (blobuploader) - INFO - Iteration through files over. 07:47:57 INFO - Return code: 0 07:47:57 INFO - rmtree: /builds/slave/test/build/uploaded_files.json 07:47:57 INFO - retry: Calling remove with args: ('/builds/slave/test/build/uploaded_files.json',), kwargs: {}, attempt #1 07:47:57 INFO - Setting buildbot property blobber_files to {"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/13ea173bdfe14a8ff8df4d73a6abfd315b1e81f445cd6d809ab5886e8202f2f9cf90c284fb6161d9dbda17633a1cd584da083717a22378f38dbfb075a5f44473", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/fa2134511437b6c57d47462ba2acae53aac7c2aeb995d8dff2a0ca81feea99b1ca6d9ab384f110c517cab06033add6cc8a1998ecaf0874bee0ac4fba19e55b55", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/7a37d674a48052f3c31905233b638e9b33c1883808daad5cdebaa5867261efb2a0610d87453ef6de916b957b895c86d88f3759f8e0d386328cfa4a55f888ee5b"} 07:47:57 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test/properties/blobber_files 07:47:57 INFO - Writing to file /builds/slave/test/properties/blobber_files 07:47:57 INFO - Contents: 07:47:57 INFO - blobber_files:{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/13ea173bdfe14a8ff8df4d73a6abfd315b1e81f445cd6d809ab5886e8202f2f9cf90c284fb6161d9dbda17633a1cd584da083717a22378f38dbfb075a5f44473", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/fa2134511437b6c57d47462ba2acae53aac7c2aeb995d8dff2a0ca81feea99b1ca6d9ab384f110c517cab06033add6cc8a1998ecaf0874bee0ac4fba19e55b55", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/7a37d674a48052f3c31905233b638e9b33c1883808daad5cdebaa5867261efb2a0610d87453ef6de916b957b895c86d88f3759f8e0d386328cfa4a55f888ee5b"} 07:47:57 INFO - Running post-run listener: copy_logs_to_upload_dir 07:47:57 INFO - Copying logs to upload dir... 07:47:57 INFO - mkdir: /builds/slave/test/build/upload/logs 07:47:57 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1676.707271 ========= master_lag: 0.01 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 27 mins, 56 secs) (at 2016-09-17 07:47:56.302763) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-09-17 07:47:56.306474) ========= 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=5bd038846534b2fdfa68eeae000001e2-1474121999.168975-1245787711 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/Mozilla-Aurora/sha512/13ea173bdfe14a8ff8df4d73a6abfd315b1e81f445cd6d809ab5886e8202f2f9cf90c284fb6161d9dbda17633a1cd584da083717a22378f38dbfb075a5f44473", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/fa2134511437b6c57d47462ba2acae53aac7c2aeb995d8dff2a0ca81feea99b1ca6d9ab384f110c517cab06033add6cc8a1998ecaf0874bee0ac4fba19e55b55", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/7a37d674a48052f3c31905233b638e9b33c1883808daad5cdebaa5867261efb2a0610d87453ef6de916b957b895c86d88f3759f8e0d386328cfa4a55f888ee5b"} build_url:https://queue.taskcluster.net/v1/task/dEe2JI-8Qv2bXOdj8oNC1w/artifacts/public/build/firefox-50.0a2.en-US.linux-x86_64.tar.bz2 program finished with exit code 0 elapsedTime=0.011522 build_url: 'https://queue.taskcluster.net/v1/task/dEe2JI-8Qv2bXOdj8oNC1w/artifacts/public/build/firefox-50.0a2.en-US.linux-x86_64.tar.bz2' blobber_files: '{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/13ea173bdfe14a8ff8df4d73a6abfd315b1e81f445cd6d809ab5886e8202f2f9cf90c284fb6161d9dbda17633a1cd584da083717a22378f38dbfb075a5f44473", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/fa2134511437b6c57d47462ba2acae53aac7c2aeb995d8dff2a0ca81feea99b1ca6d9ab384f110c517cab06033add6cc8a1998ecaf0874bee0ac4fba19e55b55", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/7a37d674a48052f3c31905233b638e9b33c1883808daad5cdebaa5867261efb2a0610d87453ef6de916b957b895c86d88f3759f8e0d386328cfa4a55f888ee5b"}' ========= master_lag: 0.01 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-09-17 07:47:56.332479) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-09-17 07:47:56.332823) ========= 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=5bd038846534b2fdfa68eeae000001e2-1474121999.168975-1245787711 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004312 ========= master_lag: 0.08 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-09-17 07:47:56.416073) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2016-09-17 07:47:56.416434) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2016-09-17 07:47:56.416776) ========= ========= Total master_lag: 0.17 =========