builder: mozilla-aurora_ubuntu64_hw_test-dromaeojs-pgo slave: talos-linux64-ix-057 starttime: 1461528633.13 results: success (0) buildid: 20160424102753 builduid: d14d90509eb54ee6a376eba70ca98df5 revision: 892d0f1308f87e9ac1ef7810fa6fde9864e550fa ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2016-04-24 13:10:33.127201) ========= master: http://buildbot-master105.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2016-04-24 13:10:33.127609) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-04-24 13:10:33.128181) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-04-24 13:10:33.153746) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-04-24 13:10:33.154060) ========= bash -c 'wget -Oarchiver_client.py --no-check-certificate --tries=10 --waitretry=3 https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py' in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', 'wget -Oarchiver_client.py --no-check-certificate --tries=10 --waitretry=3 https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=934fc3100db09dcb9af4d4b6000001ab-1461528399.567872-973537465 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2016-04-24 13:10:34-- https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py Resolving hg.mozilla.org (hg.mozilla.org)... 63.245.215.102, 63.245.215.25 Connecting to hg.mozilla.org (hg.mozilla.org)|63.245.215.102|:443... connected. HTTP request sent, awaiting response... 200 Script output follows Length: 12141 (12K) [text/x-python] Saving to: `archiver_client.py' 0K .......... . 100% 220M=0s 2016-04-24 13:10:34 (220 MB/s) - `archiver_client.py' saved [12141/12141] program finished with exit code 0 elapsedTime=0.114557 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-04-24 13:10:33.289336) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-04-24 13:10:33.289650) ========= rm -rf scripts properties in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['rm', '-rf', 'scripts', 'properties'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=934fc3100db09dcb9af4d4b6000001ab-1461528399.567872-973537465 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.013518 ========= master_lag: 0.04 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-04-24 13:10:33.345394) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-04-24 13:10:33.345777) ========= bash -c 'python archiver_client.py mozharness --repo releases/mozilla-aurora --rev 892d0f1308f87e9ac1ef7810fa6fde9864e550fa --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 892d0f1308f87e9ac1ef7810fa6fde9864e550fa --destination scripts --debug'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=934fc3100db09dcb9af4d4b6000001ab-1461528399.567872-973537465 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2016-04-24 13:10:34,244 truncating revision to first 12 chars 2016-04-24 13:10:34,244 Setting DEBUG logging. 2016-04-24 13:10:34,244 attempt 1/10 2016-04-24 13:10:34,244 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/releases/mozilla-aurora/892d0f1308f8?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2016-04-24 13:10:34,490 unpacking tar archive at: mozilla-aurora-892d0f1308f8/testing/mozharness/ program finished with exit code 0 elapsedTime=0.520847 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-04-24 13:10:33.882914) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-04-24 13:10:33.883234) ========= script_repo_revision: 892d0f1308f87e9ac1ef7810fa6fde9864e550fa ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-04-24 13:10:33.883633) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-04-24 13:10:33.883932) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-04-24 13:10:33.892324) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 51 secs) (at 2016-04-24 13:10:33.892622) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs --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', '--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=934fc3100db09dcb9af4d4b6000001ab-1461528399.567872-973537465 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 13:10:34 INFO - MultiFileLogger online at 20160424 13:10:34 in /builds/slave/test 13:10:34 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs --add-option --webServer,localhost --branch-name Mozilla-Aurora --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Mozilla-Aurora 13:10:34 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 13:10:34 INFO - {'append_to_log': False, 13:10:34 INFO - 'base_work_dir': '/builds/slave/test', 13:10:34 INFO - 'blob_upload_branch': 'Mozilla-Aurora', 13:10:34 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 13:10:34 INFO - 'branch': 'Mozilla-Aurora', 13:10:34 INFO - 'buildbot_json_path': 'buildprops.json', 13:10:34 INFO - 'config_files': ('talos/linux_config.py',), 13:10:34 INFO - 'default_actions': ('clobber', 13:10:34 INFO - 'read-buildbot-config', 13:10:34 INFO - 'download-and-extract', 13:10:34 INFO - 'populate-webroot', 13:10:34 INFO - 'create-virtualenv', 13:10:34 INFO - 'install', 13:10:34 INFO - 'run-tests'), 13:10:34 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 13:10:34 INFO - 'download_minidump_stackwalk': True, 13:10:34 INFO - 'download_symbols': 'ondemand', 13:10:34 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 13:10:34 INFO - 'tooltool.py': '/tools/tooltool.py', 13:10:34 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 13:10:34 INFO - '/tools/misc-python/virtualenv.py')}, 13:10:34 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 13:10:34 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 13:10:34 INFO - 'installer_path': 'installer.exe', 13:10:34 INFO - 'log_level': 'info', 13:10:34 INFO - 'log_name': 'talos', 13:10:34 INFO - 'log_to_console': True, 13:10:34 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 13:10:34 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 13:10:34 INFO - 'opt_config_files': (), 13:10:34 INFO - 'pip_index': False, 13:10:34 INFO - 'sps_profile': False, 13:10:34 INFO - 'sps_profile_interval': 0, 13:10:34 INFO - 'suite': 'dromaeojs', 13:10:34 INFO - 'system_bits': '32', 13:10:34 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 13:10:34 INFO - 'title': 'talos-linux64-ix-057', 13:10:34 INFO - 'tooltool_cache': '/builds/tooltool_cache', 13:10:34 INFO - 'use_talos_json': True, 13:10:34 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 13:10:34 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 13:10:34 INFO - 'work_dir': 'build'} 13:10:34 INFO - ##### 13:10:34 INFO - ##### Running clobber step. 13:10:34 INFO - ##### 13:10:34 INFO - Running pre-action listener: _resource_record_pre_action 13:10:34 INFO - Running main action method: clobber 13:10:34 INFO - rmtree: /builds/slave/test/build 13:10:34 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 13:10:35 INFO - Running post-action listener: _resource_record_post_action 13:10:35 INFO - ##### 13:10:35 INFO - ##### Running read-buildbot-config step. 13:10:35 INFO - ##### 13:10:35 INFO - Running pre-action listener: _resource_record_pre_action 13:10:35 INFO - Running main action method: read_buildbot_config 13:10:35 INFO - Using buildbot properties: 13:10:35 INFO - { 13:10:35 INFO - "project": "", 13:10:35 INFO - "product": "firefox", 13:10:35 INFO - "script_repo_revision": "production", 13:10:35 INFO - "builddir": "mozilla-aurora_ubuntu64_hw_test-dromaeojs", 13:10:35 INFO - "repository": "", 13:10:35 INFO - "buildername": "Ubuntu HW 12.04 x64 mozilla-aurora pgo talos dromaeojs", 13:10:35 INFO - "buildid": "20160424102753", 13:10:35 INFO - "pgo_build": "True", 13:10:35 INFO - "basedir": "/builds/slave/test", 13:10:35 INFO - "buildnumber": 282, 13:10:35 INFO - "slavename": "talos-linux64-ix-057", 13:10:35 INFO - "master": "http://buildbot-master105.bb.releng.scl3.mozilla.com:8201/", 13:10:35 INFO - "platform": "ubuntu64_hw", 13:10:35 INFO - "scheduler": "tests-mozilla-aurora-linux64-pgo-talos", 13:10:35 INFO - "branch": "mozilla-aurora", 13:10:35 INFO - "repo_path": "releases/mozilla-aurora", 13:10:35 INFO - "revision": "892d0f1308f87e9ac1ef7810fa6fde9864e550fa", 13:10:35 INFO - "stage_platform": "linux64-pgo", 13:10:35 INFO - "builduid": "d14d90509eb54ee6a376eba70ca98df5", 13:10:35 INFO - "slavebuilddir": "test" 13:10:35 INFO - } 13:10:35 INFO - Found installer url https://queue.taskcluster.net/v1/task/Ffpw445VShOp2q0DdGojNg/artifacts/public/build/firefox-47.0a2.en-US.linux-x86_64.tar.bz2. 13:10:35 INFO - Running post-action listener: _resource_record_post_action 13:10:35 INFO - ##### 13:10:35 INFO - ##### Running download-and-extract step. 13:10:35 INFO - ##### 13:10:35 INFO - Running pre-action listener: _resource_record_pre_action 13:10:35 INFO - Running main action method: download_and_extract 13:10:35 INFO - mkdir: /builds/slave/test/build/tests 13:10:35 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')]} 13:10:35 INFO - https://queue.taskcluster.net/v1/task/Ffpw445VShOp2q0DdGojNg/artifacts/public/build/firefox-47.0a2.en-US.linux-x86_64.test_packages.json matches https://queue.taskcluster.net 13:10:35 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Ffpw445VShOp2q0DdGojNg/artifacts/public/build/firefox-47.0a2.en-US.linux-x86_64.test_packages.json 13:10:35 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Ffpw445VShOp2q0DdGojNg/artifacts/public/build/firefox-47.0a2.en-US.linux-x86_64.test_packages.json 13:10:35 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Ffpw445VShOp2q0DdGojNg/artifacts/public/build/firefox-47.0a2.en-US.linux-x86_64.test_packages.json to /builds/slave/test/build/firefox-47.0a2.en-US.linux-x86_64.test_packages.json 13:10:35 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Ffpw445VShOp2q0DdGojNg/artifacts/public/build/firefox-47.0a2.en-US.linux-x86_64.test_packages.json', 'file_name': '/builds/slave/test/build/firefox-47.0a2.en-US.linux-x86_64.test_packages.json'}, attempt #1 13:10:43 INFO - Downloaded 1448 bytes. 13:10:43 INFO - Reading from file /builds/slave/test/build/firefox-47.0a2.en-US.linux-x86_64.test_packages.json 13:10:43 INFO - Using the following test package requirements: 13:10:43 INFO - {u'common': [u'firefox-47.0a2.en-US.linux-x86_64.common.tests.zip'], 13:10:43 INFO - u'cppunittest': [u'firefox-47.0a2.en-US.linux-x86_64.common.tests.zip', 13:10:43 INFO - u'firefox-47.0a2.en-US.linux-x86_64.cppunittest.tests.zip'], 13:10:43 INFO - u'gtest': [u'firefox-47.0a2.en-US.linux-x86_64.common.tests.zip', 13:10:43 INFO - u'firefox-47.0a2.en-US.linux-x86_64.gtest.tests.zip'], 13:10:43 INFO - u'jittest': [u'firefox-47.0a2.en-US.linux-x86_64.common.tests.zip', 13:10:43 INFO - u'jsshell-linux-x86_64.zip'], 13:10:43 INFO - u'mochitest': [u'firefox-47.0a2.en-US.linux-x86_64.common.tests.zip', 13:10:43 INFO - u'firefox-47.0a2.en-US.linux-x86_64.mochitest.tests.zip'], 13:10:43 INFO - u'mozbase': [u'firefox-47.0a2.en-US.linux-x86_64.common.tests.zip'], 13:10:43 INFO - u'reftest': [u'firefox-47.0a2.en-US.linux-x86_64.common.tests.zip', 13:10:43 INFO - u'firefox-47.0a2.en-US.linux-x86_64.reftest.tests.zip'], 13:10:43 INFO - u'talos': [u'firefox-47.0a2.en-US.linux-x86_64.common.tests.zip', 13:10:43 INFO - u'firefox-47.0a2.en-US.linux-x86_64.talos.tests.zip'], 13:10:43 INFO - u'web-platform': [u'firefox-47.0a2.en-US.linux-x86_64.common.tests.zip', 13:10:43 INFO - u'firefox-47.0a2.en-US.linux-x86_64.web-platform.tests.zip'], 13:10:43 INFO - u'webapprt': [u'firefox-47.0a2.en-US.linux-x86_64.common.tests.zip'], 13:10:43 INFO - u'xpcshell': [u'firefox-47.0a2.en-US.linux-x86_64.common.tests.zip', 13:10:43 INFO - u'firefox-47.0a2.en-US.linux-x86_64.xpcshell.tests.zip']} 13:10:43 INFO - Downloading packages: [u'firefox-47.0a2.en-US.linux-x86_64.common.tests.zip'] for test suite category: common 13:10:43 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')]} 13:10:43 INFO - https://queue.taskcluster.net/v1/task/Ffpw445VShOp2q0DdGojNg/artifacts/public/build/firefox-47.0a2.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 13:10:43 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Ffpw445VShOp2q0DdGojNg/artifacts/public/build/firefox-47.0a2.en-US.linux-x86_64.common.tests.zip 13:10:43 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Ffpw445VShOp2q0DdGojNg/artifacts/public/build/firefox-47.0a2.en-US.linux-x86_64.common.tests.zip 13:10:43 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Ffpw445VShOp2q0DdGojNg/artifacts/public/build/firefox-47.0a2.en-US.linux-x86_64.common.tests.zip to /builds/slave/test/build/firefox-47.0a2.en-US.linux-x86_64.common.tests.zip 13:10:43 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Ffpw445VShOp2q0DdGojNg/artifacts/public/build/firefox-47.0a2.en-US.linux-x86_64.common.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-47.0a2.en-US.linux-x86_64.common.tests.zip'}, attempt #1 13:11:03 INFO - Downloaded 23359875 bytes. 13:11:03 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-47.0a2.en-US.linux-x86_64.common.tests.zip', '-d', '/builds/slave/test/build/tests'] 13:11:03 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-47.0a2.en-US.linux-x86_64.common.tests.zip -d /builds/slave/test/build/tests 13:11:04 INFO - Return code: 0 13:11:04 INFO - Downloading packages: [u'firefox-47.0a2.en-US.linux-x86_64.common.tests.zip', u'firefox-47.0a2.en-US.linux-x86_64.talos.tests.zip'] for test suite category: talos 13:11: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')]} 13:11:04 INFO - https://queue.taskcluster.net/v1/task/Ffpw445VShOp2q0DdGojNg/artifacts/public/build/firefox-47.0a2.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 13:11:04 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Ffpw445VShOp2q0DdGojNg/artifacts/public/build/firefox-47.0a2.en-US.linux-x86_64.common.tests.zip 13:11:04 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Ffpw445VShOp2q0DdGojNg/artifacts/public/build/firefox-47.0a2.en-US.linux-x86_64.common.tests.zip 13:11:04 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Ffpw445VShOp2q0DdGojNg/artifacts/public/build/firefox-47.0a2.en-US.linux-x86_64.common.tests.zip to /builds/slave/test/build/firefox-47.0a2.en-US.linux-x86_64.common.tests.zip 13:11:04 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Ffpw445VShOp2q0DdGojNg/artifacts/public/build/firefox-47.0a2.en-US.linux-x86_64.common.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-47.0a2.en-US.linux-x86_64.common.tests.zip'}, attempt #1 13:11:05 INFO - Downloaded 23359875 bytes. 13:11:05 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-47.0a2.en-US.linux-x86_64.common.tests.zip', '-d', '/builds/slave/test/build/tests'] 13:11:05 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-47.0a2.en-US.linux-x86_64.common.tests.zip -d /builds/slave/test/build/tests 13:11:06 INFO - Return code: 0 13:11:06 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 13:11:06 INFO - https://queue.taskcluster.net/v1/task/Ffpw445VShOp2q0DdGojNg/artifacts/public/build/firefox-47.0a2.en-US.linux-x86_64.talos.tests.zip matches https://queue.taskcluster.net 13:11:06 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Ffpw445VShOp2q0DdGojNg/artifacts/public/build/firefox-47.0a2.en-US.linux-x86_64.talos.tests.zip 13:11:06 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Ffpw445VShOp2q0DdGojNg/artifacts/public/build/firefox-47.0a2.en-US.linux-x86_64.talos.tests.zip 13:11:06 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Ffpw445VShOp2q0DdGojNg/artifacts/public/build/firefox-47.0a2.en-US.linux-x86_64.talos.tests.zip to /builds/slave/test/build/firefox-47.0a2.en-US.linux-x86_64.talos.tests.zip 13:11:06 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Ffpw445VShOp2q0DdGojNg/artifacts/public/build/firefox-47.0a2.en-US.linux-x86_64.talos.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-47.0a2.en-US.linux-x86_64.talos.tests.zip'}, attempt #1 13:11:07 INFO - Downloaded 10845194 bytes. 13:11:07 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-47.0a2.en-US.linux-x86_64.talos.tests.zip', '-d', '/builds/slave/test/build/tests'] 13:11:07 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-47.0a2.en-US.linux-x86_64.talos.tests.zip -d /builds/slave/test/build/tests 13:11:08 INFO - Return code: 0 13:11:08 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://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')]} 13:11:08 INFO - https://queue.taskcluster.net/v1/task/Ffpw445VShOp2q0DdGojNg/artifacts/public/build/firefox-47.0a2.en-US.linux-x86_64.tar.bz2 matches https://queue.taskcluster.net 13:11:08 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Ffpw445VShOp2q0DdGojNg/artifacts/public/build/firefox-47.0a2.en-US.linux-x86_64.tar.bz2 13:11:08 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Ffpw445VShOp2q0DdGojNg/artifacts/public/build/firefox-47.0a2.en-US.linux-x86_64.tar.bz2 13:11:08 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Ffpw445VShOp2q0DdGojNg/artifacts/public/build/firefox-47.0a2.en-US.linux-x86_64.tar.bz2 to /builds/slave/test/build/firefox-47.0a2.en-US.linux-x86_64.tar.bz2 13:11:08 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Ffpw445VShOp2q0DdGojNg/artifacts/public/build/firefox-47.0a2.en-US.linux-x86_64.tar.bz2', 'file_name': '/builds/slave/test/build/firefox-47.0a2.en-US.linux-x86_64.tar.bz2'}, attempt #1 13:11:09 INFO - Downloaded 60837169 bytes. 13:11:09 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/Ffpw445VShOp2q0DdGojNg/artifacts/public/build/firefox-47.0a2.en-US.linux-x86_64.tar.bz2 13:11:09 INFO - mkdir: /builds/slave/test/properties 13:11:09 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 13:11:09 INFO - Writing to file /builds/slave/test/properties/build_url 13:11:09 INFO - Contents: 13:11:09 INFO - build_url:https://queue.taskcluster.net/v1/task/Ffpw445VShOp2q0DdGojNg/artifacts/public/build/firefox-47.0a2.en-US.linux-x86_64.tar.bz2 13:11:10 INFO - Running post-action listener: _resource_record_post_action 13:11:10 INFO - Running post-action listener: set_extra_try_arguments 13:11:10 INFO - ##### 13:11:10 INFO - ##### Running populate-webroot step. 13:11:10 INFO - ##### 13:11:10 INFO - Running pre-action listener: _resource_record_pre_action 13:11:10 INFO - Running main action method: populate_webroot 13:11:10 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 13:11:10 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 13:11:10 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 13:11:10 INFO - '--tppagecycles', 13:11:10 INFO - '7'], 13:11:10 INFO - 'tests': ['tsvgm']}}, 13:11:10 INFO - 'suites': {'chromez': {'tests': ['tresize', 'tcanvasmark']}, 13:11:10 INFO - 'chromez-e10s': {'talos_options': ['--e10s'], 13:11:10 INFO - 'tests': ['tresize', 'tcanvasmark']}, 13:11:10 INFO - 'dromaeojs': {'tests': ['dromaeo_css', 'kraken']}, 13:11:10 INFO - 'dromaeojs-e10s': {'talos_options': ['--e10s'], 13:11:10 INFO - 'tests': ['dromaeo_css', 'kraken']}, 13:11:10 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 13:11:10 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 13:11:10 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 13:11:10 INFO - 'talos_options': ['--e10s'], 13:11:10 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 13:11:10 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 13:11:10 INFO - 'tests': ['damp', 'tps']}, 13:11:10 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 13:11:10 INFO - 'talos_options': ['--e10s'], 13:11:10 INFO - 'tests': ['damp', 'tps']}, 13:11:10 INFO - 'g3': {'tests': ['dromaeo_dom']}, 13:11:10 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 13:11:10 INFO - 'other': {'tests': ['a11yr', 13:11:10 INFO - 'ts_paint', 13:11:10 INFO - 'tpaint', 13:11:10 INFO - 'sessionrestore', 13:11:10 INFO - 'sessionrestore_no_auto_restore', 13:11:10 INFO - 'tabpaint']}, 13:11:10 INFO - 'other-e10s': {'talos_options': ['--e10s'], 13:11:10 INFO - 'tests': ['a11yr', 13:11:10 INFO - 'ts_paint', 13:11:10 INFO - 'tpaint', 13:11:10 INFO - 'sessionrestore', 13:11:10 INFO - 'sessionrestore_no_auto_restore', 13:11:10 INFO - 'tabpaint']}, 13:11:10 INFO - 'other-e10s_l64': {'talos_options': ['--e10s'], 13:11:10 INFO - 'tests': ['a11yr', 13:11:10 INFO - 'ts_paint', 13:11:10 INFO - 'tpaint', 13:11:10 INFO - 'sessionrestore', 13:11:10 INFO - 'sessionrestore_no_auto_restore', 13:11:10 INFO - 'tabpaint']}, 13:11:10 INFO - 'other-e10s_nol64': {'talos_options': ['--e10s'], 13:11:10 INFO - 'tests': ['a11yr', 13:11:10 INFO - 'ts_paint', 13:11:10 INFO - 'tpaint', 13:11:10 INFO - 'sessionrestore', 13:11:10 INFO - 'sessionrestore_no_auto_restore', 13:11:10 INFO - 'tabpaint']}, 13:11:10 INFO - 'other_l64': {'tests': ['a11yr', 13:11:10 INFO - 'ts_paint', 13:11:10 INFO - 'tpaint', 13:11:10 INFO - 'sessionrestore', 13:11:10 INFO - 'sessionrestore_no_auto_restore', 13:11:10 INFO - 'tabpaint']}, 13:11:10 INFO - 'other_nol64': {'tests': ['a11yr', 13:11:10 INFO - 'ts_paint', 13:11:10 INFO - 'tpaint', 13:11:10 INFO - 'sessionrestore', 13:11:10 INFO - 'sessionrestore_no_auto_restore', 13:11:10 INFO - 'tabpaint']}, 13:11:10 INFO - 'svgr': {'tests': ['tsvgx', 13:11:10 INFO - 'tsvgr_opacity', 13:11:10 INFO - 'tart', 13:11:10 INFO - 'tscrollx', 13:11:10 INFO - 'cart']}, 13:11:10 INFO - 'svgr-e10s': {'talos_options': ['--e10s'], 13:11:10 INFO - 'tests': ['tsvgx', 13:11:10 INFO - 'tsvgr_opacity', 13:11:10 INFO - 'tart', 13:11:10 INFO - 'tscrollx', 13:11:10 INFO - 'cart']}, 13:11:10 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 13:11:10 INFO - 'tests': ['tp5o']}, 13:11:10 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 13:11:10 INFO - 'talos_options': ['--e10s'], 13:11:10 INFO - 'tests': ['tp5o']}, 13:11:10 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 13:11:10 INFO - 'talos_options': ['--xperf_path', 13:11:10 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 13:11:10 INFO - 'tests': ['tp5n']}, 13:11:10 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 13:11:10 INFO - 'talos_options': ['--e10s', 13:11:10 INFO - '--xperf_path', 13:11:10 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 13:11:10 INFO - 'tests': ['tp5n']}}, 13:11:10 INFO - 'talos.zip': {'path': '', 13:11:10 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 13:11:10 INFO - Running post-action listener: _resource_record_post_action 13:11:10 INFO - ##### 13:11:10 INFO - ##### Running create-virtualenv step. 13:11:10 INFO - ##### 13:11:10 INFO - Running pre-action listener: _resource_record_pre_action 13:11:10 INFO - Running main action method: create_virtualenv 13:11:10 INFO - Creating virtualenv /builds/slave/test/build/venv 13:11:10 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 13:11:10 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 13:11:10 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 13:11:10 INFO - Using real prefix '/usr' 13:11:10 INFO - New python executable in /builds/slave/test/build/venv/bin/python 13:11:10 INFO - Installing distribute.............................................................................................................................................................................................done. 13:11:12 INFO - Installing pip.................done. 13:11:12 INFO - Return code: 0 13:11:12 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 13:11:12 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 13:11:12 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 13:11:12 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 13:11:12 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 13:11:12 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 13:11:12 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 13:11:12 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 0x7fd939b67f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1ae18a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1bae410>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1c3d160>, '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 0x1c3e060>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1c3e4f0>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '934fc3100db09dcb9af4d4b6000001ab-1461528399.567872-973537465', '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 13:11:12 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 13:11:12 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 13:11:12 INFO - Using env: {'DISPLAY': ':0', 13:11:12 INFO - 'HOME': '/home/cltbld', 13:11:12 INFO - 'LANG': 'en_US.UTF-8', 13:11:12 INFO - 'LANGUAGE': 'en_US:en', 13:11:12 INFO - 'LOGNAME': 'cltbld', 13:11:12 INFO - 'MAIL': '/var/mail/cltbld', 13:11:12 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 13:11:12 INFO - 'MOZ_NO_REMOTE': '1', 13:11:12 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 13:11:12 INFO - 'NO_EM_RESTART': '1', 13:11:12 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 13:11:12 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 13:11:12 INFO - 'PWD': '/builds/slave/test', 13:11:12 INFO - 'SHELL': '/bin/bash', 13:11:12 INFO - 'SHLVL': '1', 13:11:12 INFO - 'TERM': 'linux', 13:11:12 INFO - 'TMOUT': '86400', 13:11:12 INFO - 'USER': 'cltbld', 13:11:12 INFO - 'XDG_SESSION_COOKIE': '934fc3100db09dcb9af4d4b6000001ab-1461528399.567872-973537465', 13:11:12 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 13:11:12 INFO - '_': '/tools/buildbot/bin/python'} 13:11:13 INFO - Ignoring indexes: https://pypi.python.org/simple/ 13:11:13 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 13:11:13 INFO - Cleaning up... 13:11:13 INFO - Return code: 0 13:11:13 INFO - Installing psutil>=0.7.1 into virtualenv /builds/slave/test/build/venv 13:11:13 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')]} 13:11:13 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 13:11:13 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 13:11:13 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')]} 13:11:13 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 13:11:13 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 13:11:13 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>=0.7.1']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fd939b67f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1ae18a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1bae410>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1c3d160>, '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 0x1c3e060>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1c3e4f0>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '934fc3100db09dcb9af4d4b6000001ab-1461528399.567872-973537465', '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 13:11:13 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>=0.7.1'] in /builds/slave/test/build 13:11:13 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>=0.7.1 13:11:13 INFO - Using env: {'DISPLAY': ':0', 13:11:13 INFO - 'HOME': '/home/cltbld', 13:11:13 INFO - 'LANG': 'en_US.UTF-8', 13:11:13 INFO - 'LANGUAGE': 'en_US:en', 13:11:13 INFO - 'LOGNAME': 'cltbld', 13:11:13 INFO - 'MAIL': '/var/mail/cltbld', 13:11:13 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 13:11:13 INFO - 'MOZ_NO_REMOTE': '1', 13:11:13 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 13:11:13 INFO - 'NO_EM_RESTART': '1', 13:11:13 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 13:11:13 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 13:11:13 INFO - 'PWD': '/builds/slave/test', 13:11:13 INFO - 'SHELL': '/bin/bash', 13:11:13 INFO - 'SHLVL': '1', 13:11:13 INFO - 'TERM': 'linux', 13:11:13 INFO - 'TMOUT': '86400', 13:11:13 INFO - 'USER': 'cltbld', 13:11:13 INFO - 'XDG_SESSION_COOKIE': '934fc3100db09dcb9af4d4b6000001ab-1461528399.567872-973537465', 13:11:13 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 13:11:13 INFO - '_': '/tools/buildbot/bin/python'} 13:11:13 INFO - Ignoring indexes: https://pypi.python.org/simple/ 13:11:13 INFO - Downloading/unpacking psutil>=0.7.1 13:11:13 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 13:11:13 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 13:11:13 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 13:11:13 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 13:11:13 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 13:11:13 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 13:11:15 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 13:11:15 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 13:11:15 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 13:11:15 INFO - Installing collected packages: psutil 13:11:15 INFO - Running setup.py install for psutil 13:11:15 INFO - building 'psutil._psutil_linux' extension 13:11:15 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 13:11:15 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 13:11:15 INFO - building 'psutil._psutil_posix' extension 13:11:15 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 13:11:15 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 13:11:15 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 13:11:15 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 13:11:15 INFO - Successfully installed psutil 13:11:15 INFO - Cleaning up... 13:11:15 INFO - Return code: 0 13:11:15 INFO - Installing mozsystemmonitor==0.0.0 into virtualenv /builds/slave/test/build/venv 13:11:15 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://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')]} 13:11:15 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 13:11:15 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 13:11:15 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://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')]} 13:11:15 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 13:11:15 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 13:11:15 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.0.0']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fd939b67f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1ae18a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1bae410>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1c3d160>, '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 0x1c3e060>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1c3e4f0>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '934fc3100db09dcb9af4d4b6000001ab-1461528399.567872-973537465', '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 13:11:15 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.0.0'] in /builds/slave/test/build 13:11:15 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.0.0 13:11:15 INFO - Using env: {'DISPLAY': ':0', 13:11:15 INFO - 'HOME': '/home/cltbld', 13:11:15 INFO - 'LANG': 'en_US.UTF-8', 13:11:15 INFO - 'LANGUAGE': 'en_US:en', 13:11:15 INFO - 'LOGNAME': 'cltbld', 13:11:15 INFO - 'MAIL': '/var/mail/cltbld', 13:11:15 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 13:11:15 INFO - 'MOZ_NO_REMOTE': '1', 13:11:15 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 13:11:15 INFO - 'NO_EM_RESTART': '1', 13:11:15 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 13:11:15 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 13:11:15 INFO - 'PWD': '/builds/slave/test', 13:11:15 INFO - 'SHELL': '/bin/bash', 13:11:15 INFO - 'SHLVL': '1', 13:11:15 INFO - 'TERM': 'linux', 13:11:15 INFO - 'TMOUT': '86400', 13:11:15 INFO - 'USER': 'cltbld', 13:11:15 INFO - 'XDG_SESSION_COOKIE': '934fc3100db09dcb9af4d4b6000001ab-1461528399.567872-973537465', 13:11:15 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 13:11:15 INFO - '_': '/tools/buildbot/bin/python'} 13:11:15 INFO - Ignoring indexes: https://pypi.python.org/simple/ 13:11:15 INFO - Downloading/unpacking mozsystemmonitor==0.0.0 13:11:15 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 13:11:15 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 13:11:15 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 13:11:15 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 13:11:15 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 13:11:15 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 13:11:17 INFO - Downloading mozsystemmonitor-0.0.tar.gz 13:11:17 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 13:11:17 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=0.7.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.0.0) 13:11:17 INFO - Installing collected packages: mozsystemmonitor 13:11:17 INFO - Running setup.py install for mozsystemmonitor 13:11:17 INFO - Successfully installed mozsystemmonitor 13:11:17 INFO - Cleaning up... 13:11:18 INFO - Return code: 0 13:11:18 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 13:11: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')]} 13:11:18 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 13:11:18 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 13:11: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')]} 13:11:18 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 13:11:18 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 13:11:18 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 0x7fd939b67f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1ae18a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1bae410>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1c3d160>, '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 0x1c3e060>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1c3e4f0>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '934fc3100db09dcb9af4d4b6000001ab-1461528399.567872-973537465', '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 13:11:18 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 13:11:18 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 13:11:18 INFO - Using env: {'DISPLAY': ':0', 13:11:18 INFO - 'HOME': '/home/cltbld', 13:11:18 INFO - 'LANG': 'en_US.UTF-8', 13:11:18 INFO - 'LANGUAGE': 'en_US:en', 13:11:18 INFO - 'LOGNAME': 'cltbld', 13:11:18 INFO - 'MAIL': '/var/mail/cltbld', 13:11:18 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 13:11:18 INFO - 'MOZ_NO_REMOTE': '1', 13:11:18 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 13:11:18 INFO - 'NO_EM_RESTART': '1', 13:11:18 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 13:11:18 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 13:11:18 INFO - 'PWD': '/builds/slave/test', 13:11:18 INFO - 'SHELL': '/bin/bash', 13:11:18 INFO - 'SHLVL': '1', 13:11:18 INFO - 'TERM': 'linux', 13:11:18 INFO - 'TMOUT': '86400', 13:11:18 INFO - 'USER': 'cltbld', 13:11:18 INFO - 'XDG_SESSION_COOKIE': '934fc3100db09dcb9af4d4b6000001ab-1461528399.567872-973537465', 13:11:18 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 13:11:18 INFO - '_': '/tools/buildbot/bin/python'} 13:11:18 INFO - Ignoring indexes: https://pypi.python.org/simple/ 13:11:18 INFO - Downloading/unpacking blobuploader==1.2.4 13:11:18 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 13:11:18 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 13:11:18 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 13:11:18 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 13:11:18 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 13:11:18 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 13:11:20 INFO - Downloading blobuploader-1.2.4.tar.gz 13:11:20 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 13:11:20 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 13:11:20 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 13:11:20 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 13:11:20 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 13:11:20 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 13:11:20 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 13:11:20 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 13:11:20 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 13:11:20 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 13:11:20 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 13:11:20 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 13:11:20 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 13:11:20 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 13:11:20 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 13:11:20 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 13:11:20 INFO - Downloading docopt-0.6.1.tar.gz 13:11:20 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 13:11:20 INFO - Installing collected packages: blobuploader, requests, docopt 13:11:20 INFO - Running setup.py install for blobuploader 13:11:20 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 13:11:20 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 13:11:21 INFO - Running setup.py install for requests 13:11:21 INFO - Running setup.py install for docopt 13:11:21 INFO - Successfully installed blobuploader requests docopt 13:11:21 INFO - Cleaning up... 13:11:21 INFO - Return code: 0 13:11:21 INFO - Installing None into virtualenv /builds/slave/test/build/venv 13:11:21 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')]} 13:11:21 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 13:11:21 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 13:11:21 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')]} 13:11:21 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 13:11:21 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 13:11:21 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 0x7fd939b67f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1ae18a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1bae410>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1c3d160>, '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 0x1c3e060>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1c3e4f0>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build/tests/config', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '934fc3100db09dcb9af4d4b6000001ab-1461528399.567872-973537465', '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 13:11:21 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 13:11:21 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 13:11:21 INFO - Using env: {'DISPLAY': ':0', 13:11:21 INFO - 'HOME': '/home/cltbld', 13:11:21 INFO - 'LANG': 'en_US.UTF-8', 13:11:21 INFO - 'LANGUAGE': 'en_US:en', 13:11:21 INFO - 'LOGNAME': 'cltbld', 13:11:21 INFO - 'MAIL': '/var/mail/cltbld', 13:11:21 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 13:11:21 INFO - 'MOZ_NO_REMOTE': '1', 13:11:21 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 13:11:21 INFO - 'NO_EM_RESTART': '1', 13:11:21 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 13:11:21 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 13:11:21 INFO - 'PWD': '/builds/slave/test', 13:11:21 INFO - 'SHELL': '/bin/bash', 13:11:21 INFO - 'SHLVL': '1', 13:11:21 INFO - 'TERM': 'linux', 13:11:21 INFO - 'TMOUT': '86400', 13:11:21 INFO - 'USER': 'cltbld', 13:11:21 INFO - 'XDG_SESSION_COOKIE': '934fc3100db09dcb9af4d4b6000001ab-1461528399.567872-973537465', 13:11:21 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 13:11:21 INFO - '_': '/tools/buildbot/bin/python'} 13:11:21 INFO - Ignoring indexes: https://pypi.python.org/simple/ 13:11:21 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 13:11:21 INFO - Running setup.py (path:/tmp/pip-yUKLCH-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 13:11:21 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 13:11:21 INFO - Running setup.py (path:/tmp/pip-o3_79U-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 13:11:21 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 13:11:21 INFO - Running setup.py (path:/tmp/pip-UKuCaD-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 13:11:21 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 13:11:21 INFO - Running setup.py (path:/tmp/pip-yICvRJ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 13:11:22 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 13:11:22 INFO - Running setup.py (path:/tmp/pip-v_i1yE-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 13:11:22 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 13:11:22 INFO - Running setup.py (path:/tmp/pip-4QC7_T-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 13:11:22 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 13:11:22 INFO - Running setup.py (path:/tmp/pip-SptgPm-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 13:11:22 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 13:11:22 INFO - Running setup.py (path:/tmp/pip-uX39w5-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 13:11:22 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 13:11:22 INFO - Running setup.py (path:/tmp/pip-7CMrpX-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 13:11:22 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 13:11:22 INFO - Running setup.py (path:/tmp/pip-Vd6zb7-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 13:11:22 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 13:11:22 INFO - Running setup.py (path:/tmp/pip-OQ6iqy-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 13:11:22 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 13:11:22 INFO - Running setup.py (path:/tmp/pip-TFiySQ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 13:11:22 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 13:11:22 INFO - Running setup.py (path:/tmp/pip-ZYGNuT-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 13:11:22 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 13:11:22 INFO - Running setup.py (path:/tmp/pip-n50mmj-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 13:11:22 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 13:11:22 INFO - Running setup.py (path:/tmp/pip-xBQhxt-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 13:11:22 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 13:11:22 INFO - Running setup.py (path:/tmp/pip-ZVoqrU-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 13:11:22 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 13:11:22 INFO - Running setup.py (path:/tmp/pip-uBnp0y-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 13:11:22 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 13:11:22 INFO - Running setup.py install for manifestparser 13:11:23 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 13:11:23 INFO - Running setup.py install for mozcrash 13:11:23 INFO - Running setup.py install for mozdebug 13:11:23 INFO - Running setup.py install for mozdevice 13:11:23 INFO - Installing sutini script to /builds/slave/test/build/venv/bin 13:11:23 INFO - Installing dm script to /builds/slave/test/build/venv/bin 13:11:23 INFO - Running setup.py install for mozfile 13:11:23 INFO - Running setup.py install for mozhttpd 13:11:23 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 13:11:23 INFO - Running setup.py install for mozinfo 13:11:23 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 13:11:23 INFO - Running setup.py install for mozInstall 13:11:23 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 13:11:23 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 13:11:23 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 13:11:23 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 13:11:23 INFO - Running setup.py install for mozleak 13:11:23 INFO - Running setup.py install for mozlog 13:11:23 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 13:11:23 INFO - Running setup.py install for moznetwork 13:11:24 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 13:11:24 INFO - Running setup.py install for mozprocess 13:11:24 INFO - Running setup.py install for mozprofile 13:11:24 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 13:11:24 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 13:11:24 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 13:11:24 INFO - Running setup.py install for mozrunner 13:11:24 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 13:11:24 INFO - Running setup.py install for mozscreenshot 13:11:24 INFO - Running setup.py install for moztest 13:11:24 INFO - Running setup.py install for mozversion 13:11:24 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 13:11:24 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 13:11:24 INFO - Cleaning up... 13:11:24 INFO - Return code: 0 13:11:24 INFO - Installing None into virtualenv /builds/slave/test/build/venv 13:11:24 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')]} 13:11:24 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 13:11:24 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 13:11:24 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')]} 13:11:24 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 13:11:24 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 13:11:24 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 0x7fd939b67f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1ae18a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1bae410>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1c3d160>, '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 0x1c3e060>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1c3e4f0>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build/tests/config', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '934fc3100db09dcb9af4d4b6000001ab-1461528399.567872-973537465', '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 13:11:24 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 13:11:24 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 13:11:24 INFO - Using env: {'DISPLAY': ':0', 13:11:24 INFO - 'HOME': '/home/cltbld', 13:11:24 INFO - 'LANG': 'en_US.UTF-8', 13:11:24 INFO - 'LANGUAGE': 'en_US:en', 13:11:24 INFO - 'LOGNAME': 'cltbld', 13:11:24 INFO - 'MAIL': '/var/mail/cltbld', 13:11:24 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 13:11:24 INFO - 'MOZ_NO_REMOTE': '1', 13:11:24 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 13:11:24 INFO - 'NO_EM_RESTART': '1', 13:11:24 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 13:11:24 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 13:11:24 INFO - 'PWD': '/builds/slave/test', 13:11:24 INFO - 'SHELL': '/bin/bash', 13:11:24 INFO - 'SHLVL': '1', 13:11:24 INFO - 'TERM': 'linux', 13:11:24 INFO - 'TMOUT': '86400', 13:11:24 INFO - 'USER': 'cltbld', 13:11:24 INFO - 'XDG_SESSION_COOKIE': '934fc3100db09dcb9af4d4b6000001ab-1461528399.567872-973537465', 13:11:24 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 13:11:24 INFO - '_': '/tools/buildbot/bin/python'} 13:11:24 INFO - Ignoring indexes: https://pypi.python.org/simple/ 13:11:24 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 13:11:24 INFO - Running setup.py (path:/tmp/pip-76F_Aa-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 13:11:25 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)) 13:11:25 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 13:11:25 INFO - Running setup.py (path:/tmp/pip-eljBOl-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 13:11:25 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)) 13:11:25 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 13:11:25 INFO - Running setup.py (path:/tmp/pip-hblWKA-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 13:11:25 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)) 13:11:25 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 13:11:25 INFO - Running setup.py (path:/tmp/pip-7_wy8C-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 13:11:25 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)) 13:11:25 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 13:11:25 INFO - Running setup.py (path:/tmp/pip-L9ot5L-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 13:11:25 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)) 13:11:25 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 13:11:25 INFO - Running setup.py (path:/tmp/pip-rJ3LyH-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 13:11:25 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)) 13:11:25 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 13:11:25 INFO - Running setup.py (path:/tmp/pip-H5rICx-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 13:11:25 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)) 13:11:25 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 13:11:25 INFO - Running setup.py (path:/tmp/pip-g5F1lB-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 13:11:25 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)) 13:11:25 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 13:11:25 INFO - Running setup.py (path:/tmp/pip-HlQbbK-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 13:11:25 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)) 13:11:25 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 13:11:25 INFO - Running setup.py (path:/tmp/pip-A288jP-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 13:11:25 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog==3.1 from file:///builds/slave/test/build/tests/mozbase/mozlog in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 13:11:25 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 13:11:25 INFO - Running setup.py (path:/tmp/pip-NEwrDG-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 13:11:25 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)) 13:11:25 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 13:11:25 INFO - Running setup.py (path:/tmp/pip-3MRw88-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 13:11:25 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess==0.22 from file:///builds/slave/test/build/tests/mozbase/mozprocess in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 12)) 13:11:25 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 13:11:25 INFO - Running setup.py (path:/tmp/pip-6MaBhD-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 13:11:25 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)) 13:11:25 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 13:11:25 INFO - Running setup.py (path:/tmp/pip-l5FY7j-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 13:11:26 INFO - Requirement already satisfied (use --upgrade to upgrade): mozrunner==6.11 from file:///builds/slave/test/build/tests/mozbase/mozrunner in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 14)) 13:11:26 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 13:11:26 INFO - Running setup.py (path:/tmp/pip-Vk7eAm-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 13:11:26 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)) 13:11:26 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 13:11:26 INFO - Running setup.py (path:/tmp/pip-cFNQ8Q-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 13:11:26 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)) 13:11:26 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 13:11:26 INFO - Running setup.py (path:/tmp/pip-Ve2HIc-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 13:11:26 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)) 13:11:26 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)) 13:11:26 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)) 13:11:26 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)) 13:11:26 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)) 13:11:26 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)) 13:11:26 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.1->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 13:11:26 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 13:11:26 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 13:11:26 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 13:11:26 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 13:11:26 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 13:11:26 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 13:11:28 INFO - Downloading blessings-1.6.tar.gz 13:11:28 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 13:11:28 INFO - Installing collected packages: blessings 13:11:28 INFO - Running setup.py install for blessings 13:11:28 INFO - Successfully installed blessings 13:11:28 INFO - Cleaning up... 13:11:28 INFO - Return code: 0 13:11:28 INFO - Done creating virtualenv /builds/slave/test/build/venv. 13:11:28 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 13:11:28 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 13:11:28 INFO - Reading from file tmpfile_stdout 13:11:28 INFO - Current package versions: 13:11:28 INFO - argparse == 1.2.1 13:11:28 INFO - blessings == 1.6 13:11:28 INFO - blobuploader == 1.2.4 13:11:28 INFO - docopt == 0.6.1 13:11:28 INFO - manifestparser == 1.1 13:11:28 INFO - mozInstall == 1.12 13:11:28 INFO - mozcrash == 0.17 13:11:28 INFO - mozdebug == 0.1 13:11:28 INFO - mozdevice == 0.48 13:11:28 INFO - mozfile == 1.2 13:11:28 INFO - mozhttpd == 0.7 13:11:28 INFO - mozinfo == 0.9 13:11:28 INFO - mozleak == 0.1 13:11:28 INFO - mozlog == 3.1 13:11:28 INFO - moznetwork == 0.27 13:11:28 INFO - mozprocess == 0.22 13:11:28 INFO - mozprofile == 0.28 13:11:28 INFO - mozrunner == 6.11 13:11:28 INFO - mozscreenshot == 0.1 13:11:28 INFO - mozsystemmonitor == 0.0 13:11:28 INFO - moztest == 0.7 13:11:28 INFO - mozversion == 1.4 13:11:28 INFO - psutil == 3.1.1 13:11:28 INFO - requests == 1.2.3 13:11:28 INFO - wsgiref == 0.1.2 13:11:28 INFO - Installing None into virtualenv /builds/slave/test/build/venv 13:11:28 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')]} 13:11:28 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 13:11:28 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 13:11:28 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')]} 13:11:28 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 13:11:28 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 13:11:28 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 0x7fd939b67f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1ae18a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1bae410>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1c3d160>, '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 0x1c3e060>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1c3e4f0>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build/tests/talos', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '934fc3100db09dcb9af4d4b6000001ab-1461528399.567872-973537465', '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 13:11:28 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 13:11:28 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 13:11:28 INFO - Using env: {'DISPLAY': ':0', 13:11:28 INFO - 'HOME': '/home/cltbld', 13:11:28 INFO - 'LANG': 'en_US.UTF-8', 13:11:28 INFO - 'LANGUAGE': 'en_US:en', 13:11:28 INFO - 'LOGNAME': 'cltbld', 13:11:28 INFO - 'MAIL': '/var/mail/cltbld', 13:11:28 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 13:11:28 INFO - 'MOZ_NO_REMOTE': '1', 13:11:28 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 13:11:28 INFO - 'NO_EM_RESTART': '1', 13:11:28 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 13:11:28 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 13:11:28 INFO - 'PWD': '/builds/slave/test', 13:11:28 INFO - 'SHELL': '/bin/bash', 13:11:28 INFO - 'SHLVL': '1', 13:11:28 INFO - 'TERM': 'linux', 13:11:28 INFO - 'TMOUT': '86400', 13:11:28 INFO - 'USER': 'cltbld', 13:11:28 INFO - 'XDG_SESSION_COOKIE': '934fc3100db09dcb9af4d4b6000001ab-1461528399.567872-973537465', 13:11:28 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 13:11:28 INFO - '_': '/tools/buildbot/bin/python'} 13:11:28 INFO - Ignoring indexes: https://pypi.python.org/simple/ 13:11:28 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)) 13:11:28 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)) 13:11:28 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)) 13:11:28 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)) 13:11:28 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)) 13:11:28 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)) 13:11:28 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)) 13:11:28 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)) 13:11:28 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)) 13:11:28 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)) 13:11:28 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)) 13:11:28 INFO - Cleaning up... 13:11:28 INFO - Return code: 0 13:11:28 INFO - Installing jsonschema into virtualenv /builds/slave/test/build/venv 13:11:28 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')]} 13:11:28 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 13:11:28 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 13:11:28 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')]} 13:11:28 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 13:11:28 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 13:11:28 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 0x7fd939b67f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1ae18a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1bae410>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1c3d160>, '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 0x1c3e060>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1c3e4f0>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '934fc3100db09dcb9af4d4b6000001ab-1461528399.567872-973537465', '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 13:11:28 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 13:11:28 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 13:11:28 INFO - Using env: {'DISPLAY': ':0', 13:11:28 INFO - 'HOME': '/home/cltbld', 13:11:28 INFO - 'LANG': 'en_US.UTF-8', 13:11:28 INFO - 'LANGUAGE': 'en_US:en', 13:11:28 INFO - 'LOGNAME': 'cltbld', 13:11:28 INFO - 'MAIL': '/var/mail/cltbld', 13:11:28 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 13:11:28 INFO - 'MOZ_NO_REMOTE': '1', 13:11:28 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 13:11:28 INFO - 'NO_EM_RESTART': '1', 13:11:28 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 13:11:28 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 13:11:28 INFO - 'PWD': '/builds/slave/test', 13:11:28 INFO - 'SHELL': '/bin/bash', 13:11:28 INFO - 'SHLVL': '1', 13:11:28 INFO - 'TERM': 'linux', 13:11:28 INFO - 'TMOUT': '86400', 13:11:28 INFO - 'USER': 'cltbld', 13:11:28 INFO - 'XDG_SESSION_COOKIE': '934fc3100db09dcb9af4d4b6000001ab-1461528399.567872-973537465', 13:11:28 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 13:11:28 INFO - '_': '/tools/buildbot/bin/python'} 13:11:28 INFO - Ignoring indexes: https://pypi.python.org/simple/ 13:11:29 INFO - Downloading/unpacking jsonschema 13:11:29 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 13:11:29 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 13:11:29 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 13:11:29 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 13:11:29 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 13:11:29 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 13:11:30 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 13:11:30 INFO - Downloading/unpacking functools32 (from jsonschema) 13:11:30 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 13:11:30 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 13:11:30 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 13:11:30 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 13:11:30 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 13:11:30 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 13:11:31 INFO - Downloading functools32-3.2.3-2.tar.gz 13:11:31 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/functools32/setup.py) egg_info for package functools32 13:11:31 INFO - warning: no files found matching '*.txt' 13:11:31 INFO - no previously-included directories found matching 'build' 13:11:31 INFO - no previously-included directories found matching 'dist' 13:11:31 INFO - no previously-included directories found matching '.git*' 13:11:31 INFO - Installing collected packages: jsonschema, functools32 13:11:31 INFO - Running setup.py install for functools32 13:11:31 INFO - warning: no files found matching '*.txt' 13:11:31 INFO - no previously-included directories found matching 'build' 13:11:31 INFO - no previously-included directories found matching 'dist' 13:11:31 INFO - no previously-included directories found matching '.git*' 13:11:31 INFO - Successfully installed jsonschema functools32 13:11:31 INFO - Cleaning up... 13:11:31 INFO - Return code: 0 13:11:31 INFO - Installing flake8 into virtualenv /builds/slave/test/build/venv 13:11:31 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 13:11:31 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 13:11:31 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 13:11:31 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 13:11:31 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 13:11:31 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 13:11:31 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', 'flake8']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fd939b67f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1ae18a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1bae410>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1c3d160>, '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 0x1c3e060>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1c3e4f0>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '934fc3100db09dcb9af4d4b6000001ab-1461528399.567872-973537465', '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 13:11:31 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', 'flake8'] in /builds/slave/test/build 13:11:31 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 flake8 13:11:31 INFO - Using env: {'DISPLAY': ':0', 13:11:31 INFO - 'HOME': '/home/cltbld', 13:11:31 INFO - 'LANG': 'en_US.UTF-8', 13:11:31 INFO - 'LANGUAGE': 'en_US:en', 13:11:31 INFO - 'LOGNAME': 'cltbld', 13:11:31 INFO - 'MAIL': '/var/mail/cltbld', 13:11:31 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 13:11:31 INFO - 'MOZ_NO_REMOTE': '1', 13:11:31 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 13:11:31 INFO - 'NO_EM_RESTART': '1', 13:11:31 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 13:11:31 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 13:11:31 INFO - 'PWD': '/builds/slave/test', 13:11:31 INFO - 'SHELL': '/bin/bash', 13:11:31 INFO - 'SHLVL': '1', 13:11:31 INFO - 'TERM': 'linux', 13:11:31 INFO - 'TMOUT': '86400', 13:11:31 INFO - 'USER': 'cltbld', 13:11:31 INFO - 'XDG_SESSION_COOKIE': '934fc3100db09dcb9af4d4b6000001ab-1461528399.567872-973537465', 13:11:31 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 13:11:31 INFO - '_': '/tools/buildbot/bin/python'} 13:11:31 INFO - Ignoring indexes: https://pypi.python.org/simple/ 13:11:31 INFO - Downloading/unpacking flake8 13:11:31 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 13:11:31 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 13:11:31 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 13:11:31 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 13:11:31 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 13:11:31 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 13:11:33 INFO - Downloading flake8-2.5.0-py2.py3-none-any.whl 13:11:33 INFO - Downloading/unpacking mccabe>=0.2.1,<0.4 (from flake8) 13:11:33 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 13:11:33 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 13:11:33 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 13:11:33 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 13:11:33 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 13:11:33 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 13:11:33 INFO - Downloading mccabe-0.3.1-py2.py3-none-any.whl 13:11:33 INFO - Downloading/unpacking pyflakes>=0.8.1,<1.1 (from flake8) 13:11:33 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 13:11:33 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 13:11:33 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 13:11:33 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 13:11:33 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 13:11:33 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 13:11:33 INFO - Downloading/unpacking pep8>=1.5.7,!=1.6.0,!=1.6.1,!=1.6.2 (from flake8) 13:11:33 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 13:11:33 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 13:11:33 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 13:11:33 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 13:11:33 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 13:11:33 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 13:11:34 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/pep8/setup.py) egg_info for package pep8 13:11:34 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 13:11:34 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 13:11:34 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 13:11:34 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 13:11:34 INFO - no previously-included directories found matching 'docs/_build' 13:11:34 INFO - Installing collected packages: flake8, mccabe, pyflakes, pep8 13:11:34 INFO - Running setup.py install for pep8 13:11:34 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 13:11:34 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 13:11:34 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 13:11:34 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 13:11:34 INFO - no previously-included directories found matching 'docs/_build' 13:11:34 INFO - Installing pep8 script to /builds/slave/test/build/venv/bin 13:11:34 INFO - Successfully installed flake8 mccabe pyflakes pep8 13:11:34 INFO - Cleaning up... 13:11:34 INFO - Return code: 0 13:11:34 INFO - Running post-action listener: _resource_record_post_action 13:11:34 INFO - Running post-action listener: _start_resource_monitoring 13:11:34 INFO - Starting resource monitoring. 13:11:34 INFO - ##### 13:11:34 INFO - ##### Running install step. 13:11:34 INFO - ##### 13:11:34 INFO - Running pre-action listener: _resource_record_pre_action 13:11:34 INFO - Running main action method: install 13:11:34 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 13:11:34 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 13:11:34 INFO - Reading from file tmpfile_stdout 13:11:34 INFO - Detecting whether we're running mozinstall >=1.0... 13:11:34 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 13:11:34 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 13:11:34 INFO - Reading from file tmpfile_stdout 13:11:34 INFO - Output received: 13:11:34 INFO - Usage: mozinstall [options] installer 13:11:34 INFO - Options: 13:11:34 INFO - -h, --help show this help message and exit 13:11:34 INFO - -d DEST, --destination=DEST 13:11:34 INFO - Directory to install application into. [default: 13:11:34 INFO - "/builds/slave/test"] 13:11:34 INFO - --app=APP Application being installed. [default: firefox] 13:11:34 INFO - mkdir: /builds/slave/test/build/application 13:11:34 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '/builds/slave/test/build/firefox-47.0a2.en-US.linux-x86_64.tar.bz2', '--destination', '/builds/slave/test/build/application'] 13:11:34 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall /builds/slave/test/build/firefox-47.0a2.en-US.linux-x86_64.tar.bz2 --destination /builds/slave/test/build/application 13:11:49 INFO - Reading from file tmpfile_stdout 13:11:49 INFO - Output received: 13:11:49 INFO - /builds/slave/test/build/application/firefox/firefox 13:11:49 INFO - Running post-action listener: _resource_record_post_action 13:11:49 INFO - ##### 13:11:49 INFO - ##### Running run-tests step. 13:11:49 INFO - ##### 13:11:49 INFO - Running pre-action listener: _resource_record_pre_action 13:11:49 INFO - Running main action method: run_tests 13:11:49 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 13:11:49 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 13:11:49 INFO - Python 2.7.3 13:11:49 INFO - Return code: 0 13:11:49 INFO - grabbing minidump binary from tooltool 13:11:49 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 13:11:49 INFO - retry: Calling run_command with args: (['/tools/tooltool.py', '--url', 'https://api.pub.build.mozilla.org/tooltool/', '--authentication-file', '/builds/relengapi.tok', 'fetch', '-m', '/builds/slave/test/build/tests/config/tooltool-manifests/linux64/releng.manifest', '-o', '-c', '/builds/tooltool_cache'],), kwargs: {'error_list': [{'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1c3d160>, '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 0x1c3e060>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1c3e4f0>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 13:11:49 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 13:11:49 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 13:11:50 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 13:11:50 INFO - Return code: 0 13:11:50 INFO - Chmoding /builds/slave/test/build/linux64-minidump_stackwalk to 0755 13:11:50 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 13:11:50 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 13:11:50 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/linux64-minidump_stackwalk 13:11:50 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 13:11:50 INFO - Running command: ['/builds/slave/test/build/venv/bin/flake8', '/builds/slave/test/build/tests/talos/talos'] 13:11:50 INFO - Copy/paste: /builds/slave/test/build/venv/bin/flake8 /builds/slave/test/build/tests/talos/talos 13:11:51 INFO - Return code: 0 13:11:51 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', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/Ffpw445VShOp2q0DdGojNg/artifacts/public/build/firefox-47.0a2.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-057', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log'] in /builds/slave/test/build 13:11:51 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 --executablePath /builds/slave/test/build/application/firefox/firefox --symbolsPath https://queue.taskcluster.net/v1/task/Ffpw445VShOp2q0DdGojNg/artifacts/public/build/firefox-47.0a2.en-US.linux-x86_64.crashreporter-symbols.zip --title talos-linux64-ix-057 --webServer localhost --log-tbpl-level=debug --log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log --log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log 13:11:51 INFO - Using env: {'DISPLAY': ':0', 13:11:51 INFO - 'HOME': '/home/cltbld', 13:11:51 INFO - 'LANG': 'en_US.UTF-8', 13:11:51 INFO - 'LANGUAGE': 'en_US:en', 13:11:51 INFO - 'LOGNAME': 'cltbld', 13:11:51 INFO - 'MAIL': '/var/mail/cltbld', 13:11:51 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 13:11:51 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/linux64-minidump_stackwalk', 13:11:51 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 13:11:51 INFO - 'MOZ_NO_REMOTE': '1', 13:11:51 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 13:11:51 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 13:11:51 INFO - 'NO_EM_RESTART': '1', 13:11:51 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 13:11:51 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 13:11:51 INFO - 'PWD': '/builds/slave/test', 13:11:51 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 13:11:51 INFO - 'SHELL': '/bin/bash', 13:11:51 INFO - 'SHLVL': '1', 13:11:51 INFO - 'TERM': 'linux', 13:11:51 INFO - 'TMOUT': '86400', 13:11:51 INFO - 'USER': 'cltbld', 13:11:51 INFO - 'XDG_SESSION_COOKIE': '934fc3100db09dcb9af4d4b6000001ab-1461528399.567872-973537465', 13:11:51 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 13:11:51 INFO - '_': '/tools/buildbot/bin/python'} 13:11:51 INFO - Calling ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Mozilla-Aurora', '--suite', 'dromaeojs', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/Ffpw445VShOp2q0DdGojNg/artifacts/public/build/firefox-47.0a2.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-057', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log'] with output_timeout 3600 13:11:51 INFO - mozversion application_buildid: 20160424102753 13:11:51 INFO - mozversion application_changeset: 892d0f1308f87e9ac1ef7810fa6fde9864e550fa 13:11:51 INFO - mozversion application_display_name: FirefoxDeveloperEdition 13:11:51 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 13:11:51 INFO - mozversion application_name: Firefox 13:11:51 INFO - mozversion application_remotingname: firefox-dev 13:11:51 INFO - mozversion application_repository: https://hg.mozilla.org/releases/mozilla-aurora 13:11:51 INFO - mozversion application_vendor: Mozilla 13:11:51 INFO - mozversion application_version: 47.0a2 13:11:51 INFO - mozversion platform_buildid: 20160424102753 13:11:51 INFO - mozversion platform_changeset: 892d0f1308f87e9ac1ef7810fa6fde9864e550fa 13:11:51 INFO - mozversion platform_repository: https://hg.mozilla.org/releases/mozilla-aurora 13:11:51 INFO - mozversion platform_version: 47.0a2 13:11:51 INFO - using testdate: 1461528711 13:11:51 INFO - actual date: 1461528711 13:11:51 INFO - starting webserver on 'localhost:53072' 13:11:51 INFO - SUITE-START | Running 2 tests 13:11:51 INFO - TEST-START | dromaeo_css 13:11:51 INFO - operating with platform_type : linux_ 13:11:51 INFO - Initialising browser for dromaeo_css test... 13:11:51 INFO - TEST-INFO | started process 23622 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpKbwGwl/profile http://localhost:53072/getInfo.html) 13:11:55 INFO - PROCESS | 23622 | __metrics Screen width/height:1600/1200 13:11:55 INFO - PROCESS | 23622 | colorDepth:24 13:11:55 INFO - PROCESS | 23622 | Browser inner width/height: 1024/697 13:11:55 INFO - PROCESS | 23622 | __metrics 13:11:56 INFO - PROCESS | 23622 | JavaScript error: resource://app/modules/WebappManager.jsm, line 48: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 13:11:57 INFO - TEST-INFO | 23622: exit 0 13:11:57 INFO - Browser initialized. 13:11:57 INFO - Running cycle 1/1 for dromaeo_css test... 13:11:57 INFO - TEST-INFO | started process 23713 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpKbwGwl/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 13:12:09 INFO - PROCESS | 23713 | RSS: Main: 141840384 13:12:09 INFO - PROCESS | 23713 | 13:13:00 INFO - PROCESS | 23713 | 1461528780893 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] 13:15:08 INFO - PROCESS | 23713 | Cycle 1(1): loaded http://localhost:53072/tests/dromaeo/cssquery-dojo.html (next: http://localhost:53072/tests/dromaeo/cssquery-ext.html) 13:15:09 INFO - PROCESS | 23713 | RSS: Main: 255938560 13:15:09 INFO - PROCESS | 23713 | 13:18:11 INFO - PROCESS | 23713 | Cycle 1(1): loaded http://localhost:53072/tests/dromaeo/cssquery-ext.html (next: http://localhost:53072/tests/dromaeo/cssquery-jquery.html) 13:18:12 INFO - PROCESS | 23713 | RSS: Main: 226496512 13:18:12 INFO - PROCESS | 23713 | 13:21:13 INFO - PROCESS | 23713 | Cycle 1(1): loaded http://localhost:53072/tests/dromaeo/cssquery-jquery.html (next: http://localhost:53072/tests/dromaeo/cssquery-mootools.html) 13:21:14 INFO - PROCESS | 23713 | RSS: Main: 221061120 13:21:14 INFO - PROCESS | 23713 | 13:24:16 INFO - PROCESS | 23713 | Cycle 1(1): loaded http://localhost:53072/tests/dromaeo/cssquery-mootools.html (next: http://localhost:53072/tests/dromaeo/cssquery-prototype.html) 13:24:16 INFO - PROCESS | 23713 | RSS: Main: 196902912 13:24:16 INFO - PROCESS | 23713 | 13:27:19 INFO - PROCESS | 23713 | Cycle 1(1): loaded http://localhost:53072/tests/dromaeo/cssquery-prototype.html (next: http://localhost:53072/tests/dromaeo/cssquery-yui.html) 13:27:20 INFO - PROCESS | 23713 | RSS: Main: 213450752 13:27:20 INFO - PROCESS | 23713 | 13:30:22 INFO - PROCESS | 23713 | Cycle 1(1): loaded http://localhost:53072/tests/dromaeo/cssquery-yui.html (next: http://localhost:53072/tests/dromaeo/cssquery-dojo.html) 13:30:22 INFO - PROCESS | 23713 | RSS: Main: 245993472 13:30:22 INFO - PROCESS | 23713 | 13:30:22 INFO - PROCESS | 23713 | __start_tp_report 13:30:22 INFO - PROCESS | 23713 | _x_x_mozilla_page_load 13:30:22 INFO - PROCESS | 23713 | _x_x_mozilla_page_load_details 13:30:22 INFO - PROCESS | 23713 | |i|pagename|runs| 13:30:22 INFO - PROCESS | 23713 | |0;dojo.html;3294.4893541501065;3307.2393349529593;3373.865045398184;3376.27410106827;3410.931781364373;5389.191621256813;5400.081986062369;5405.972970135143;5427.0773968425365;5460.426655201206;5392.137258038714;5394.514493695567;5425.430329815372;5431.646942948715;5431.83704488865;4748.833790817322;4930.6302027348;4976.552110310071;4992.825251116212;5031.4465408805;4926.605871530269;5017.422996355411;5019.347484826967;5019.874503137433;5023.497650234984;4908.43552991407;4981.9252711209365;5015.924761128586;5033.748312584375;5056.19100943849;5042.495750424965;5048.444671086178;5060.974695126538;5068.898622027539;5116.1302578561545;4818.590419814285;4872.537108974641;4939.209726443752;4954.281629163751;4971.1549036663855;5307.893842123136;5348.251244825728;5350.3312085989255;5352.384475785296;5376.865578360573;5687.573431992617;5770.711464426762;5834.358220595731;5865.882682346371;5882.647041177543;5802.506786923117;5844.386339434341;5872.882542349172;5882.176495290662;5900.822975310747;5472.616916815825;5474.42518535552;5479.726013699299;5488.69812160327;5491.121420572689;5855.209546711225;5943.435373639497;5991.64050156992;6010.909836352458;6032.819015429544;5790.247267855236;5807.12893066035;5807.303123625107;5808.506276966421;5815.331236907809;5866.501347385435;5879.676617785977;5884.264466941632;5884.9705751470965;5886.558508111909;5683.829485115453;5733.627314224562;5797.652140871562;5817.0983497557945;5847.26909136358;5745.109508026179;5754.4533269339345;5758.452946970031;5759.424057594207;5768.4808367246305;4371.344298355272;4399.560043995639;4407.4050003249795;4407.845725399596;4433.224185767478;3861.7489863158803;3971.523417189898;4008.7995600219874;4027.35562310029;4061.3704875744306;5418.810341638024;5425.050616142159;5440.156775699773;5459.754311056012;5486.807961721321;5714.514266287329;5775.48020678141;5793.7392817323325;5796.710164491758;5796.855078623068;5438;5468.28912241414;5493.395726470085;5503.394626591072;5518.365387980433;4997.350344455198;5031.4465408805;5037.11850426174;5040.873978150576;5065.493450654905;5801.9419805802245;5997.55018373615;6049.758009679564;6065.211522502046;6066.029435290332;5800.042992906292;5848.356680765198;5851.678157701367;5852.326982397079;5862.325832529314;5992.370801065999;6004.819855404345;6012.398760123952;6012.549058820693;6015.157877897011;5660.094384898396;5753.712314384347;5777.364489906191;5781.046127388934;5788.971055144697;5888.028475301699;5888.381719919518;5897.439743224387;5897.734601942837;5900.616459930091;5678.0631195853875;5717.942820571908;5726.513246374105;5732.856678583069;5744.454276843693;5585.134304182858;5623.746931388016;5704.771809127588;5747.885042299047;5778.94221057784;5660.349059858005;5673.914891276551;5705.429457054262;5709.058005429058;5715.171300161536;5800.477956983892;5816.302043754777;5823.883522329615;5831.008728516078;5834.533237340917;5478.397376288525;5478.808241711521;5610.971945140248;5650.886982260414;5683.460071293221 13:30:22 INFO - PROCESS | 23713 | |1;ext.html;564.5822091652178;571.3229822660148;583.9065749480083;596.8209537138857;658.8879890418629;31977.52033719496;39095.80452097739;39491.80254098726;39492;39636.60363396365;42683.78658106705;43003.13993720124;43091.56908430922;43391.78304108483;43435;8772.122787721224;8965.372423930328;8975.551222438884;8981;8981.910180898172;8749.256313213384;8904.955475222614;8908.554572271392;8911.821763564725;9125.908740912571;9088.091190880892;9185.770355741126;9187.26501879848;9195.12646298604;9203.447793132433;9124.224440922497;9213.585388657526;9225.169734723908;9230.815383692356;9232.723018309462;9068.546572671406;9212.263018958467;9216;9217.631294748202;9219.308551858638;42866.35700464495;43014.78492607548;43316.350254746205;43487.565124348665;43530.564694352965;3706.3513885070274;3706.666400023984;3861.4400911867624;4046.3930410438375;4229.577042295777;28899.897743405327;29416.11751647454;30931.845340773376;31432.842835785905;31729.206769830707;4221.472315960505;4296.5273819879785;4304.892377690551;4337.609615134653;4378.1462614790125;301969;305127;306324;306670;308472;67898.66050669814;68760;68772.31227687659;68828.6558567214;68832.6558367205;73637;74508.62745686236;74596.25403746002;74672.62663686647;74753.62623186849;17691.469255922344;17841.107944602718;17918.731219031724;17933.37233196832;17952.371666991592;13638.454461821417;13817.930910345585;13819.239941803096;13821.585352439442;13827;22589.77410225877;23308.533829323318;23369.182078627167;23454.530909381716;23547.646785298235;7889.802754931058;8015.957925469768;8251.257386835214;8447.873281900776;8580.442271252348;1089.6404186618397;1091.8089334366614;1126.8197088465806;1146.747715502588;1221.2428294457493;28658.713412866022;29034;29050.7094929048;29079.418411632072;29340.119796406143;1129.593346395297;1161.1407558406718;1227.5274019502376;1247.3638444393425;1284.877936596022;15096.622584435258;15382.153981530899;15595.454159104604;15829.445969391016;15898.125603091941;369821;373788;373873;374380;375004;57641.13538296929;58102;58155.418445815;58165.12752308719;58258.70870645619;1361.5438827992534;1449.3984996226447;1469.3167677030233;1488.1071357185817;1501.14434772181;27178;28952.710472895;29571.556426653187;29681.25796855096;29856;46945.765271173426;54920.176197356275;55891;55986.160207597735;55986.72006639941;303626;310833;313289;313754;319379;40001.59998399979;49884.25173622471;51445;51552.74223628858;52211.73894130657;47194.29208561806;47687;47851.52148478471;48469.75765121152;48709.26936096032;42156;42347;42634.5736542643;42724;43782.781086094365;41315.38026929538;41571.37642935419;41659.7917010413;41920.580794191665;43062.13875722531;43339.56660433482;43529.34705979476;43903.34144987891;44255.77872110619;44379.33430998473;33744.66255337415;37971.240575188895;38133.618663814115;38303.04242393851;38519.614803851604;27359.72640273572;27971;28130.85934570396;28182.577261340688;28281.858590706914 13:30:22 INFO - PROCESS | 23713 | |2;jquery.html;384.93840985442336;385.9884203473896;388.33206884159245;398.4382021349895;399.7641391578968;14462.349194286257;16628.939491607583;17400;18690;18790.436286911397;16916.492505224833;17317.7402338965;17372.56568585783;17933.103344832773;17944.82055179451;5336.17289320155;5361.919571206435;5535.418781027995;5553.444655534455;5580.107182850745;5485.067538518461;5526.668399895999;5567.610267281292;5571.777128914839;5572.916406253889;5521;5561.499465048145;5617.775288988436;5617.8033768818095;5626.071698169797;5473.959947609961;5591.692456914909;5632.633878797906;5633.183188437674;5637.915431268534;5035.647504674675;5045.899082018375;5046.21783623539;5047.293378926953;5048.596112311006;21287.787122128735;21566.460838479165;21847.235346762947;21859.781402185934;22133.446663833533;2425.9810879430684;2497;2599.7790187834057;2909.7526710229654;2936.3540021195304;13471.124376915566;13478;13762.724745505035;14126.505572305023;14267.500637477639;1880.4452686457528;1922.3944457495843;1940.2723978508059;1949.8732582382243;1966.8721533100302;62962.37037629657;63319;63591.6820415895;63760;64436.67781661109;9831.705048848546;10080.69757907264;10179.491025448699;10235.027672371112;10254;12654.87345126537;13017.21896686202;14424.423023079169;14449.277536123152;14450.205238711762;7433.182349941502;7595.620218989028;7967.322777563856;7977.441579089408;8084.3936704747375;7843.215678432111;7912.960435197787;7951.920480795234;7953.284204421514;7960.084590272077;6023.578349515579;6085.665288409092;6122.755089796358;6127.540434467343;6197.070439434031;1883.5385330594092;1890.3478299986482;1896.5163883209693;1915.1669023974616;1919.1459800388693;486.5159166629227;984.8375018122073;1022.3456987527989;1063.6657164320936;1082.929609575375;10998.450077496253;11553.537858485735;11644.24312419707;11674.416279186007;11748.353840538852;479.8512461137059;486.4527406667499;491.1870853737071;514.108022580822;524.1587252459823;6143.56995010354;6355.332690067568;6370.84072898172;6380.202474690664;6424;454964;455985;470628;476028;480316;80450;82143.5892820544;82719;82969.58515207385;83692;497.84815631232823;506.2861365474737;510.2626704412163;1024.2011231239644;1056.7596695006634;15100.622484437537;15309.311081001159;15345.769813452584;15485.458008969632;15744.29150688199;32014.199645008128;33480;35579.82210088933;36087.819560902026;36542;46467.3029904545;47145.528544714114;47576;48185.75907120442;48203;8059.153788852086;8110.83778324442;8118.775414723558;8222.218889205516;8487.872681909652;6687.465002799861;7780.84438311242;8997.55012249398;9565.612986116836;9988.850167247352;10240.283180177315;10293.073623373932;10355.689329320132;10654.414007229676;11101.11191104726;9916.851247231441;10099.343542669703;10589.417582033062;10698.251122421356;11059.557617695202;9420.764480888032;9989.150922171406;10437.530311135864;10597.311174773615;10775.030247277782;7944.245296696805;7951.443398962017;8197.385196110436;8222.259996600334;8275.255227029596;9110.863337050083;10095.798084038424;10427.374357538572;10676.946615266874;10692.19808514349 13:30:22 INFO - PROCESS | 23713 | |3;mootools.html;1395.372082562847;1569.9843001569984;1588.5155027716546;1812.7280907863826;1959.46114818425;8000.199980002004;8128.065272493665;8173.754787356382;8185.140560241178;8192.54940978246;8336.874946875801;8489.617967191476;8500.787480312994;8507.829843403128;8513.829723405528;2120.968185477219;2375.5486457573047;2391.282615215437;2406.1458182345277;2433.452473193535;2427.1262345555588;2434.926952191437;2436.2691192642224;2437.5003124359464;2438.634204869266;2338.8830558472096;2402.795762360193;2404.831661783676;2408.6025805742033;2409.5301416223842;2414.927552173429;2416.2871952773976;2459.7786199242064;2462;2467.494163696438;2401.591729406005;2402.0992127952018;2425.7331693513697;2481.4788894332214;2482.1064416809936;8611;8657;8658.04761476237;8669.739907802776;8670.783230419227;5163.40620828602;5310.070737620901;5350.3312085989255;5350.438203988564;5358.892822143535;3245.334706385185;3268.934621307584;3303.9834800826084;3375.780574262665;3395.066356751888;968.5689868008739;973.7030205787232;981.2395393569969;993.1409330928694;1002.8044531316397;12017.879821201763;12047.277163370225;12047.819282710767;12052.638420847388;12056.578019769353;4518.118966801508;4741.2414013758325;4759.619230461555;4765.785539650724;4774.641901857374;10235;10278;10290.279680422298;10291.639792607222;10301.175905927657;4692.319613656001;5197.402298735618;5259.289995850511;5389.245505629215;5393.110136827379;4696.577308042292;4734.337192793012;4774.689645173053;4776.331313616097;4777.0684716479955;3802.8478860845257;3859.073822282688;3911.1395492991496;3916.6083391661177;3945.1715139820385;1234.1361047266948;1293.9935300323439;1303.7718399280088;1314.073578127418;1316.0984725463088;1356.9118007329491;1369.8493165751759;1387.1122481611776;1429.0496819615048;1445.2123592642035;8095.635696393676;8134.59327033646;8152.062512811102;8164.101948785629;8179.67281308741;502.88433660258346;508.8015673887187;515.0548743056534;516.8268630008914;519.6284656470642;5992.700364981733;6027.969860150672;6028.517718582503;6042.818715438544;6083.330833608299;10041.447720375303;10155.543000564992;10240.590376384862;10256.12822910061;10377.584896604052;9926.851097233548;10091.646792362379;10126.696199114038;10127.848082278771;10166.4916754162;8029.879551806727;8144.389170812213;8247.835043299221;8248.917510824815;8256.422050456411;7958.562279074475;8028.718994835386;8053.194680532134;8160.347172226327;8172.427930045078;9116.908830911607;9164.495952722664;9234.861477077984;9249.12133347331;9353.625854965725;9142.314326425412;9408.29437792182;9561.37851039708;9575.712728618153;9604.279679024241;6783.491238157059;7133.500654954103;7313.524620899837;7507.587082710504;7641.579713115832;8165.714200002972;8166.510009399218;8178.059523154675;8199.508029518249;8199.631016604386;7135.322144396274;7373.410127189704;7409.8147546311775;7620;7638.618069096634;7323.7436689715605;7394.889076663747;7470.925290747023;7479.813004674927;7550.584717840571;7789.260020298063;7820.804479888048;7832.099308579586;7847.882281765664;7873.448858579844;7088.04311417952;7117.857642847218;7159.642017899188;7165.570065796069;7209.0628218331285;7308.96345518269;7309.926900730925;7341.045664063638;7363.926360736324;7368.668409921459 13:30:22 INFO - PROCESS | 23713 | |4;prototype.html;360.8069682719745;362.6699703270023;363.4439307858975;364.1805936642554;371.6209466344327;6022.969885150574;6045.7883974060915;6067.575269731126;6069.059295809146;6075.817725468232;6007.158997740309;6007.639541627505;6024;6026.849328766783;6035.486983606388;4472.396226509412;4546.454425468948;4587.518310577391;4650.813967441315;4698.765061746916;4616.746078965655;4638.165130276549;4638.466576343713;4645.372874661928;4650.348951146842;4597.310403439477;4602.355670206174;4605.608523275526;4609.354690343354;4612.0775844831;4445.755483448409;4554.089182163564;4610.585047345755;4621.19129152397;4635.11932732783;4115.36211887158;4119.279126152941;4136.8138433770555;4138.0689344897455;4144.7513149210845;5715.457031581993;5722.513586345166;5725.742341594639;5736.196932429463;5738.139279108125;5476.452354764531;5480.671159730389;5481.095619222863;5487.560995120421;5489.725513724298;6367.267764207129;6387.201599800025;6387.977923532212;6389.424951754364;6396.840078998062;4309.870703878889;4442.600165985044;4450.310201918675;4492.61812745917;4601.953980460219;6566.835829104263;6618.933810661928;6631.767888123893;6632.237292711352;6642.468602511739;4550.726956382628;4570.611498022706;4574.153781550423;4579.061292435043;4588.105319462673;4640.025594625166;4648.093621743795;4648.418947631546;4649.372334734768;4655.138799322136;5345.946540534623;5352.384475785257;5354.30394048779;5367.973160134175;5371.167469042305;6279.3720627937755;6329.525285603506;6398.8720225595225;6400.839979000469;6404.807855764335;1624.1310898669392;1631.4616176661673;1633.4527933142292;1637.2059551117698;1640.097946129624;1032.4734385463469;1071.3571856885806;1078.2344535379968;1100.9559617615205;1102.9889701103048;6011.1884895539415;6014.969925150346;6017.308009578867;6020.337762846083;6022.45797878193;6397.6801159941815;6419.775307864203;6516.283208847023;6517.837054073591;6534.673266336759;6090.451859332681;6109.389061093855;6112.297085835097;6115.724792384353;6116.266048074171;3473.913152171216;3493.703035241982;3511.596166440841;3511.9297614048087;3522.383582872987;6599.505037122139;6714.362135597111;6847;6898.206706228848;6904.378605925491;6825.283345248777;6838.042674025641;6838.589684618939;6847.417969472551;6848.246692863781;6871.244163142051;6883.036374907517;6888.207856096513;6890.896636550456;6896.586204827626;6636.7013484392355;6641.900371494528;6643.40209381158;6645.60126392418;6649.933500665125;6437.555907589417;6501.187351580863;6574.901376479261;6575.112359831362;6585.3085426029575;6815.318468153145;6851.520393572402;6855.760048398282;6862.862742745217;6869.519133660596;4580.67935244543;4630.490646028867;4634.189016922092;4637.466691330405;4640.095181439587;6637.900431493435;6659.467242620675;6693.966530167318;6713.060171575886;6729.495287853332;6343.397377249154;6441.420272175526;6458.644774537445;6474.514411419256;6488.513361497812;6429.710663020269;6450.451711604566;6460.063290822711;6462.676866156579;6483.837904052436;6321.146645203023;6339.683015849281;6340.682965851597;6343.080253363144;6351.936480635134;6450.129232553545;6485.708143133476;6487.18910136233;6500.382463665944;6511.446527045065;6061.242344706911;6181.690915454299;6338.651374174465;6358.395952384516;6358.936410635834 13:30:22 INFO - PROCESS | 23713 | |5;yui.html;745.1728581274784;747.3162056718099;753.3935182178344;883.9071897450767;895.3553441522106;13866.029377943549;13990.650233744162;14010.859891401084;14020.859791402083;14022.649433764162;13059;13157.079004469691;13170.078094533386;13171.736565268713;13196.604101876936;772.3589420780738;927.7263207353847;939.4598106088991;942.7501712046313;943.9852158929144;944.8393773058597;946.0208684012049;953.7377221264138;953.828310904037;954.341504361988;826.4627991805314;980.7891303369775;980.8234517786796;980.9705708828711;981.293468702533;976.2287792643803;984.3847595252967;984.8571957066185;986.7878406142678;987.1559816356984;728.155339805828;730.3645828129509;730.9634518274065;731.1883808972037;731.849970755999;14286.642833929234;14319.069260498034;14328.283585820667;14332.57002289933;14364.64088397788;13528.526501572398;13762.65593360174;13930.442782288696;13981.35951782218;14274.072185307921;10338.7415314617;10473;10495.475226238657;10588.364698118137;10776.245662803607;3537.5401197844117;3586.9282614347826;3603.279344131158;3653.324135035027;3708.42519409492;51102.488975110144;51164;51278.487215127745;51789.99999999962;52148;10766.73083172927;10963.83554246687;11124.443777811077;11162.832557511643;11603.129765267639;20716.171353145706;20748.066337014872;20758.377248682562;20772.169113235603;20817.89591052035;7703.268189521987;7745.302922736981;7877.527348359117;7892.408069394818;7989.920100798918;4347.913041739147;4408.7575183365225;4471.396361491222;4548.408706868152;4754.096721622881;3352.513885486591;3378.4256676365076;3386.2888793353673;3388.9830550847087;3390.593128824557;549.9092649712833;572.7508533787816;572.894014607299;574.6925394913701;584.564499447914;675.1965161457849;678.2268214235775;684.9041134241211;695.655650453029;716.5736386849816;8064.395170362129;8101.189881011852;8287.461315014505;8354.206350396702;8537.658493660309;657.5824351536713;662.5726406467801;673.5882753851726;688.5042769206163;692.7229108356597;3833.386658134685;3867.207222519377;3867.651911327994;3972.8013599320498;3975.284448799244;54526;56351.43648563544;56968.430315697144;57344;57705;50280;50375;50488;50995;50998.49001509937;45604.54395456003;45682.771586141855;46466.76766616145;46483;47252.76373618178;8176.509409435215;8221.958890205511;8529.786755331166;8542.701005464778;8547.316214702685;32336.83831580921;32465.51301730523;33318;33664;33877.83061084679;37807.43288850725;37916;43379.566204337556;44194.558054419045;45401.545984539734;11480.253783504046;11507.482163302504;11867.821982670093;12461.439235234255;12501.874981250072;11369.03363214103;11761.941190294336;11823.11326650522;11997.040236780862;12084.637460876187;11283.153763467608;11433.314001159957;11558.364289964133;11645.126615503701;11905.692972512978;10531.285721385739;10616.34591352162;10667.199960002876;10741.677749667522;10834.187435942493;10635.415052172204;10857.239993200401;11246.550137994389;11411.942940285246;11546.307221566733;8993.640254390013;9235.538223088684;9265.861012084959;9675.371100878421;9908.25688073383;9298.395604285699;9361.953190234006;9396.812063758549;9504.857427138737;9523.380980236263 13:30:22 INFO - PROCESS | 23713 | __end_tp_report 13:30:22 INFO - PROCESS | 23713 | __start_cc_report 13:30:22 INFO - PROCESS | 23713 | _x_x_mozilla_cycle_collect,907 13:30:22 INFO - PROCESS | 23713 | __end_cc_report 13:30:22 INFO - PROCESS | 23713 | __startTimestamp1461529822600__endTimestamp 13:30:22 INFO - PROCESS | 23713 | 13:30:22 INFO - PROCESS | 23713 | ------- Summary: start ------- 13:30:22 INFO - PROCESS | 23713 | Number of tests: 6 13:30:22 INFO - PROCESS | 23713 | 13:30:22 INFO - PROCESS | 23713 | [#0] dojo.html Cycles:165 Average:5421.48 Median:5660.35 stddev:593.43 (10.5%) stddev-sans-first:571.31 13:30:22 INFO - PROCESS | 23713 | Values: 3294.5 3307.2 3373.9 3376.3 3410.9 5389.2 5400.1 5406.0 5427.1 5460.4 5392.1 5394.5 5425.4 5431.6 5431.8 4748.8 4930.6 4976.6 4992.8 5031.4 4926.6 5017.4 5019.3 5019.9 5023.5 4908.4 4981.9 5015.9 5033.7 5056.2 5042.5 5048.4 5061.0 5068.9 5116.1 4818.6 4872.5 4939.2 4954.3 4971.2 5307.9 5348.3 5350.3 5352.4 5376.9 5687.6 5770.7 5834.4 5865.9 5882.6 5802.5 5844.4 5872.9 5882.2 5900.8 5472.6 5474.4 5479.7 5488.7 5491.1 5855.2 5943.4 5991.6 6010.9 6032.8 5790.2 5807.1 5807.3 5808.5 5815.3 5866.5 5879.7 5884.3 5885.0 5886.6 5683.8 5733.6 5797.7 5817.1 5847.3 5745.1 5754.5 5758.5 5759.4 5768.5 4371.3 4399.6 4407.4 4407.8 4433.2 3861.7 3971.5 4008.8 4027.4 4061.4 5418.8 5425.1 5440.2 5459.8 5486.8 5714.5 5775.5 5793.7 5796.7 5796.9 5438.0 5468.3 5493.4 5503.4 5518.4 4997.4 5031.4 5037.1 5040.9 5065.5 5801.9 5997.6 6049.8 6065.2 6066.0 5800.0 5848.4 5851.7 5852.3 5862.3 5992.4 6004.8 6012.4 6012.5 6015.2 5660.1 5753.7 5777.4 5781.0 5789.0 5888.0 5888.4 5897.4 5897.7 5900.6 5678.1 5717.9 5726.5 5732.9 5744.5 5585.1 5623.7 5704.8 5747.9 5778.9 5660.3 5673.9 5705.4 5709.1 5715.2 5800.5 5816.3 5823.9 5831.0 5834.5 5478.4 5478.8 5611.0 5650.9 5683.5 13:30:22 INFO - PROCESS | 23713 | 13:30:22 INFO - PROCESS | 23713 | [#1] ext.html Cycles:180 Average:52410.06 Median:4225.52 stddev:86850.01 (2055.4%) stddev-sans-first:87006.41 13:30:22 INFO - PROCESS | 23713 | Values: 564.6 571.3 583.9 596.8 658.9 31977.5 39095.8 39491.8 39492.0 39636.6 42683.8 43003.1 43091.6 43391.8 43435.0 8772.1 8965.4 8975.6 8981.0 8981.9 8749.3 8905.0 8908.6 8911.8 9125.9 9088.1 9185.8 9187.3 9195.1 9203.4 9124.2 9213.6 9225.2 9230.8 9232.7 9068.5 9212.3 9216.0 9217.6 9219.3 42866.4 43014.8 43316.4 43487.6 43530.6 3706.4 3706.7 3861.4 4046.4 4229.6 28899.9 29416.1 30931.8 31432.8 31729.2 4221.5 4296.5 4304.9 4337.6 4378.1 301969.0 305127.0 306324.0 306670.0 308472.0 67898.7 68760.0 68772.3 68828.7 68832.7 73637.0 74508.6 74596.3 74672.6 74753.6 17691.5 17841.1 17918.7 17933.4 17952.4 13638.5 13817.9 13819.2 13821.6 13827.0 22589.8 23308.5 23369.2 23454.5 23547.6 7889.8 8016.0 8251.3 8447.9 8580.4 1089.6 1091.8 1126.8 1146.7 1221.2 28658.7 29034.0 29050.7 29079.4 29340.1 1129.6 1161.1 1227.5 1247.4 1284.9 15096.6 15382.2 15595.5 15829.4 15898.1 369821.0 373788.0 373873.0 374380.0 375004.0 57641.1 58102.0 58155.4 58165.1 58258.7 1361.5 1449.4 1469.3 1488.1 1501.1 27178.0 28952.7 29571.6 29681.3 29856.0 46945.8 54920.2 55891.0 55986.2 55986.7 303626.0 310833.0 313289.0 313754.0 319379.0 40001.6 49884.3 51445.0 51552.7 52211.7 47194.3 47687.0 47851.5 48469.8 48709.3 42156.0 42347.0 42634.6 42724.0 43782.8 41315.4 41571.4 41659.8 41920.6 43062.1 43339.6 43529.3 43903.3 44255.8 44379.3 33744.7 37971.2 38133.6 38303.0 38519.6 27359.7 27971.0 28130.9 28182.6 28281.9 13:30:22 INFO - PROCESS | 23713 | 13:30:22 INFO - PROCESS | 23713 | [#2] jquery.html Cycles:180 Average:26327.14 Median:261802.00 stddev:76777.33 (29.3%) stddev-sans-first:76968.00 13:30:22 INFO - PROCESS | 23713 | Values: 384.9 386.0 388.3 398.4 399.8 14462.3 16628.9 17400.0 18690.0 18790.4 16916.5 17317.7 17372.6 17933.1 17944.8 5336.2 5361.9 5535.4 5553.4 5580.1 5485.1 5526.7 5567.6 5571.8 5572.9 5521.0 5561.5 5617.8 5617.8 5626.1 5474.0 5591.7 5632.6 5633.2 5637.9 5035.6 5045.9 5046.2 5047.3 5048.6 21287.8 21566.5 21847.2 21859.8 22133.4 2426.0 2497.0 2599.8 2909.8 2936.4 13471.1 13478.0 13762.7 14126.5 14267.5 1880.4 1922.4 1940.3 1949.9 1966.9 62962.4 63319.0 63591.7 63760.0 64436.7 9831.7 10080.7 10179.5 10235.0 10254.0 12654.9 13017.2 14424.4 14449.3 14450.2 7433.2 7595.6 7967.3 7977.4 8084.4 7843.2 7913.0 7951.9 7953.3 7960.1 6023.6 6085.7 6122.8 6127.5 6197.1 1883.5 1890.3 1896.5 1915.2 1919.1 486.5 984.8 1022.3 1063.7 1082.9 10998.5 11553.5 11644.2 11674.4 11748.4 479.9 486.5 491.2 514.1 524.2 6143.6 6355.3 6370.8 6380.2 6424.0 454964.0 455985.0 470628.0 476028.0 480316.0 80450.0 82143.6 82719.0 82969.6 83692.0 497.8 506.3 510.3 1024.2 1056.8 15100.6 15309.3 15345.8 15485.5 15744.3 32014.2 33480.0 35579.8 36087.8 36542.0 46467.3 47145.5 47576.0 48185.8 48203.0 8059.2 8110.8 8118.8 8222.2 8487.9 6687.5 7780.8 8997.6 9565.6 9988.9 10240.3 10293.1 10355.7 10654.4 11101.1 9916.9 10099.3 10589.4 10698.3 11059.6 9420.8 9989.2 10437.5 10597.3 10775.0 7944.2 7951.4 8197.4 8222.3 8275.3 9110.9 10095.8 10427.4 10676.9 10692.2 13:30:22 INFO - PROCESS | 23713 | 13:30:22 INFO - PROCESS | 23713 | [#3] mootools.html Cycles:180 Average:5964.81 Median:5350.38 stddev:3163.19 (59.1%) stddev-sans-first:3153.42 13:30:22 INFO - PROCESS | 23713 | Values: 1395.4 1570.0 1588.5 1812.7 1959.5 8000.2 8128.1 8173.8 8185.1 8192.5 8336.9 8489.6 8500.8 8507.8 8513.8 2121.0 2375.5 2391.3 2406.1 2433.5 2427.1 2434.9 2436.3 2437.5 2438.6 2338.9 2402.8 2404.8 2408.6 2409.5 2414.9 2416.3 2459.8 2462.0 2467.5 2401.6 2402.1 2425.7 2481.5 2482.1 8611.0 8657.0 8658.0 8669.7 8670.8 5163.4 5310.1 5350.3 5350.4 5358.9 3245.3 3268.9 3304.0 3375.8 3395.1 968.6 973.7 981.2 993.1 1002.8 12017.9 12047.3 12047.8 12052.6 12056.6 4518.1 4741.2 4759.6 4765.8 4774.6 10235.0 10278.0 10290.3 10291.6 10301.2 4692.3 5197.4 5259.3 5389.2 5393.1 4696.6 4734.3 4774.7 4776.3 4777.1 3802.8 3859.1 3911.1 3916.6 3945.2 1234.1 1294.0 1303.8 1314.1 1316.1 1356.9 1369.8 1387.1 1429.0 1445.2 8095.6 8134.6 8152.1 8164.1 8179.7 502.9 508.8 515.1 516.8 519.6 5992.7 6028.0 6028.5 6042.8 6083.3 10041.4 10155.5 10240.6 10256.1 10377.6 9926.9 10091.6 10126.7 10127.8 10166.5 8029.9 8144.4 8247.8 8248.9 8256.4 7958.6 8028.7 8053.2 8160.3 8172.4 9116.9 9164.5 9234.9 9249.1 9353.6 9142.3 9408.3 9561.4 9575.7 9604.3 6783.5 7133.5 7313.5 7507.6 7641.6 8165.7 8166.5 8178.1 8199.5 8199.6 7135.3 7373.4 7409.8 7620.0 7638.6 7323.7 7394.9 7470.9 7479.8 7550.6 7789.3 7820.8 7832.1 7847.9 7873.4 7088.0 7117.9 7159.6 7165.6 7209.1 7309.0 7309.9 7341.0 7363.9 7368.7 13:30:22 INFO - PROCESS | 23713 | 13:30:22 INFO - PROCESS | 23713 | [#4] prototype.html Cycles:180 Average:5368.22 Median:6040.64 stddev:1611.20 (26.7%) stddev-sans-first:1571.27 13:30:22 INFO - PROCESS | 23713 | Values: 360.8 362.7 363.4 364.2 371.6 6023.0 6045.8 6067.6 6069.1 6075.8 6007.2 6007.6 6024.0 6026.8 6035.5 4472.4 4546.5 4587.5 4650.8 4698.8 4616.7 4638.2 4638.5 4645.4 4650.3 4597.3 4602.4 4605.6 4609.4 4612.1 4445.8 4554.1 4610.6 4621.2 4635.1 4115.4 4119.3 4136.8 4138.1 4144.8 5715.5 5722.5 5725.7 5736.2 5738.1 5476.5 5480.7 5481.1 5487.6 5489.7 6367.3 6387.2 6388.0 6389.4 6396.8 4309.9 4442.6 4450.3 4492.6 4602.0 6566.8 6618.9 6631.8 6632.2 6642.5 4550.7 4570.6 4574.2 4579.1 4588.1 4640.0 4648.1 4648.4 4649.4 4655.1 5345.9 5352.4 5354.3 5368.0 5371.2 6279.4 6329.5 6398.9 6400.8 6404.8 1624.1 1631.5 1633.5 1637.2 1640.1 1032.5 1071.4 1078.2 1101.0 1103.0 6011.2 6015.0 6017.3 6020.3 6022.5 6397.7 6419.8 6516.3 6517.8 6534.7 6090.5 6109.4 6112.3 6115.7 6116.3 3473.9 3493.7 3511.6 3511.9 3522.4 6599.5 6714.4 6847.0 6898.2 6904.4 6825.3 6838.0 6838.6 6847.4 6848.2 6871.2 6883.0 6888.2 6890.9 6896.6 6636.7 6641.9 6643.4 6645.6 6649.9 6437.6 6501.2 6574.9 6575.1 6585.3 6815.3 6851.5 6855.8 6862.9 6869.5 4580.7 4630.5 4634.2 4637.5 4640.1 6637.9 6659.5 6694.0 6713.1 6729.5 6343.4 6441.4 6458.6 6474.5 6488.5 6429.7 6450.5 6460.1 6462.7 6483.8 6321.1 6339.7 6340.7 6343.1 6351.9 6450.1 6485.7 6487.2 6500.4 6511.4 6061.2 6181.7 6338.7 6358.4 6358.9 13:30:22 INFO - PROCESS | 23713 | 13:30:22 INFO - PROCESS | 23713 | [#5] yui.html Cycles:180 Average:13911.60 Median:46074.77 stddev:15835.15 (34.4%) stddev-sans-first:15848.70 13:30:22 INFO - PROCESS | 23713 | Values: 745.2 747.3 753.4 883.9 895.4 13866.0 13990.7 14010.9 14020.9 14022.6 13059.0 13157.1 13170.1 13171.7 13196.6 772.4 927.7 939.5 942.8 944.0 944.8 946.0 953.7 953.8 954.3 826.5 980.8 980.8 981.0 981.3 976.2 984.4 984.9 986.8 987.2 728.2 730.4 731.0 731.2 731.8 14286.6 14319.1 14328.3 14332.6 14364.6 13528.5 13762.7 13930.4 13981.4 14274.1 10338.7 10473.0 10495.5 10588.4 10776.2 3537.5 3586.9 3603.3 3653.3 3708.4 51102.5 51164.0 51278.5 51790.0 52148.0 10766.7 10963.8 11124.4 11162.8 11603.1 20716.2 20748.1 20758.4 20772.2 20817.9 7703.3 7745.3 7877.5 7892.4 7989.9 4347.9 4408.8 4471.4 4548.4 4754.1 3352.5 3378.4 3386.3 3389.0 3390.6 549.9 572.8 572.9 574.7 584.6 675.2 678.2 684.9 695.7 716.6 8064.4 8101.2 8287.5 8354.2 8537.7 657.6 662.6 673.6 688.5 692.7 3833.4 3867.2 3867.7 3972.8 3975.3 54526.0 56351.4 56968.4 57344.0 57705.0 50280.0 50375.0 50488.0 50995.0 50998.5 45604.5 45682.8 46466.8 46483.0 47252.8 8176.5 8222.0 8529.8 8542.7 8547.3 32336.8 32465.5 33318.0 33664.0 33877.8 37807.4 37916.0 43379.6 44194.6 45401.5 11480.3 11507.5 11867.8 12461.4 12501.9 11369.0 11761.9 11823.1 11997.0 12084.6 11283.2 11433.3 11558.4 11645.1 11905.7 10531.3 10616.3 10667.2 10741.7 10834.2 10635.4 10857.2 11246.6 11411.9 11546.3 8993.6 9235.5 9265.9 9675.4 9908.3 9298.4 9362.0 9396.8 9504.9 9523.4 13:30:22 INFO - PROCESS | 23713 | -------- Summary: end -------- 13:30:22 INFO - PROCESS | 23713 | 13:30:23 INFO - TEST-INFO | 23713: exit 0 13:30:23 INFO - TEST-OK | dromaeo_css | took 1111948ms 13:30:23 INFO - TEST-START | kraken 13:30:23 INFO - operating with platform_type : linux_ 13:30:23 INFO - Initialising browser for kraken test... 13:30:23 INFO - TEST-INFO | started process 23903 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpzvrmyK/profile http://localhost:53072/getInfo.html) 13:30:27 INFO - PROCESS | 23903 | __metrics Screen width/height:1600/1200 13:30:27 INFO - PROCESS | 23903 | colorDepth:24 13:30:27 INFO - PROCESS | 23903 | Browser inner width/height: 1024/697 13:30:27 INFO - PROCESS | 23903 | __metrics 13:30:28 INFO - PROCESS | 23903 | JavaScript error: resource://app/modules/WebappManager.jsm, line 48: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 13:30:29 INFO - TEST-INFO | 23903: exit 0 13:30:29 INFO - Browser initialized. 13:30:29 INFO - Running cycle 1/1 for kraken test... 13:30:29 INFO - TEST-INFO | started process 23994 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpzvrmyK/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 13:30:41 INFO - PROCESS | 23994 | RSS: Main: 141762560 13:30:41 INFO - PROCESS | 23994 | 13:30:43 INFO - PROCESS | 23994 | Cycle 1(1): loaded http://localhost:53072/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:53072/tests/kraken/driver.html?testName=audio-beat-detection) 13:30:44 INFO - PROCESS | 23994 | RSS: Main: 178040832 13:30:44 INFO - PROCESS | 23994 | 13:30:46 INFO - PROCESS | 23994 | Cycle 1(1): loaded http://localhost:53072/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:53072/tests/kraken/driver.html?testName=audio-dft) 13:30:47 INFO - PROCESS | 23994 | RSS: Main: 176836608 13:30:47 INFO - PROCESS | 23994 | 13:30:50 INFO - PROCESS | 23994 | Cycle 1(1): loaded http://localhost:53072/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:53072/tests/kraken/driver.html?testName=audio-fft) 13:30:50 INFO - PROCESS | 23994 | RSS: Main: 173535232 13:30:50 INFO - PROCESS | 23994 | 13:30:52 INFO - PROCESS | 23994 | Cycle 1(1): loaded http://localhost:53072/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:53072/tests/kraken/driver.html?testName=audio-oscillator) 13:30:53 INFO - PROCESS | 23994 | RSS: Main: 174600192 13:30:53 INFO - PROCESS | 23994 | 13:30:55 INFO - PROCESS | 23994 | Cycle 1(1): loaded http://localhost:53072/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:53072/tests/kraken/driver.html?testName=imaging-gaussian-blur) 13:30:56 INFO - PROCESS | 23994 | RSS: Main: 172126208 13:30:56 INFO - PROCESS | 23994 | 13:30:59 INFO - PROCESS | 23994 | Cycle 1(1): loaded http://localhost:53072/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:53072/tests/kraken/driver.html?testName=imaging-darkroom) 13:30:59 INFO - PROCESS | 23994 | RSS: Main: 172052480 13:30:59 INFO - PROCESS | 23994 | 13:31:03 INFO - PROCESS | 23994 | Cycle 1(1): loaded http://localhost:53072/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:53072/tests/kraken/driver.html?testName=imaging-desaturate) 13:31:03 INFO - PROCESS | 23994 | RSS: Main: 171565056 13:31:03 INFO - PROCESS | 23994 | 13:31:06 INFO - PROCESS | 23994 | Cycle 1(1): loaded http://localhost:53072/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:53072/tests/kraken/driver.html?testName=json-parse-financial) 13:31:06 INFO - PROCESS | 23994 | RSS: Main: 171716608 13:31:06 INFO - PROCESS | 23994 | 13:31:08 INFO - PROCESS | 23994 | Cycle 1(1): loaded http://localhost:53072/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:53072/tests/kraken/driver.html?testName=json-stringify-tinderbox) 13:31:09 INFO - PROCESS | 23994 | RSS: Main: 178417664 13:31:09 INFO - PROCESS | 23994 | 13:31:10 INFO - PROCESS | 23994 | Cycle 1(1): loaded http://localhost:53072/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:53072/tests/kraken/driver.html?testName=stanford-crypto-aes) 13:31:11 INFO - PROCESS | 23994 | RSS: Main: 177016832 13:31:11 INFO - PROCESS | 23994 | 13:31:13 INFO - PROCESS | 23994 | Cycle 1(1): loaded http://localhost:53072/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:53072/tests/kraken/driver.html?testName=stanford-crypto-ccm) 13:31:14 INFO - PROCESS | 23994 | RSS: Main: 186601472 13:31:14 INFO - PROCESS | 23994 | 13:31:16 INFO - PROCESS | 23994 | Cycle 1(1): loaded http://localhost:53072/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:53072/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 13:31:17 INFO - PROCESS | 23994 | RSS: Main: 190533632 13:31:17 INFO - PROCESS | 23994 | 13:31:19 INFO - PROCESS | 23994 | Cycle 1(1): loaded http://localhost:53072/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:53072/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 13:31:20 INFO - PROCESS | 23994 | RSS: Main: 189816832 13:31:20 INFO - PROCESS | 23994 | 13:31:21 INFO - PROCESS | 23994 | Cycle 1(1): loaded http://localhost:53072/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:53072/tests/kraken/driver.html?testName=ai-astar) 13:31:22 INFO - PROCESS | 23994 | RSS: Main: 251678720 13:31:22 INFO - PROCESS | 23994 | 13:31:22 INFO - PROCESS | 23994 | __start_tp_report 13:31:22 INFO - PROCESS | 23994 | _x_x_mozilla_page_load 13:31:22 INFO - PROCESS | 23994 | _x_x_mozilla_page_load_details 13:31:22 INFO - PROCESS | 23994 | |i|pagename|runs| 13:31:22 INFO - PROCESS | 23994 | |0;ai-astar;110;109;104;109;111;110;98;109;109;112 13:31:22 INFO - PROCESS | 23994 | |1;audio-beat-detection;156;127;161;165;131;152;159;127;179;135 13:31:22 INFO - PROCESS | 23994 | |2;audio-dft;161;161;161;161;161;162;160;165;160;161 13:31:22 INFO - PROCESS | 23994 | |3;audio-fft;76;77;83;161;77;76;73;76;161;76 13:31:22 INFO - PROCESS | 23994 | |4;audio-oscillator;93;93;142;93;92;94;144;93;93;141 13:31:22 INFO - PROCESS | 23994 | |5;imaging-gaussian-blur;117;117;117;117;117;117;116;117;117;116 13:31:22 INFO - PROCESS | 23994 | |6;imaging-darkroom;147;146;146;146;147;145;146;147;147;145 13:31:22 INFO - PROCESS | 23994 | |7;imaging-desaturate;95;95;95;96;96;95;95;95;96;95 13:31:22 INFO - PROCESS | 23994 | |8;json-parse-financial;54;54;56;56;55;54;60;63;53;52 13:31:22 INFO - PROCESS | 23994 | |9;json-stringify-tinderbox;66;67;72;66;67;67;66;67;67;67 13:31:22 INFO - PROCESS | 23994 | |10;stanford-crypto-aes;79;81;82;81;81;81;81;80;81;81 13:31:22 INFO - PROCESS | 23994 | |11;stanford-crypto-ccm;112;112;114;112;112;115;114;123;117;113 13:31:22 INFO - PROCESS | 23994 | |12;stanford-crypto-pbkdf2;147;144;148;135;157;133;135;138;154;145 13:31:22 INFO - PROCESS | 23994 | |13;stanford-crypto-sha256-iterative;67;68;68;66;66;67;66;69;66;66 13:31:22 INFO - PROCESS | 23994 | __end_tp_report 13:31:22 INFO - PROCESS | 23994 | __start_cc_report 13:31:22 INFO - PROCESS | 23994 | _x_x_mozilla_cycle_collect,1083 13:31:22 INFO - PROCESS | 23994 | __end_cc_report 13:31:22 INFO - PROCESS | 23994 | __startTimestamp1461529882132__endTimestamp 13:31:22 INFO - PROCESS | 23994 | 13:31:22 INFO - PROCESS | 23994 | ------- Summary: start ------- 13:31:22 INFO - PROCESS | 23994 | Number of tests: 14 13:31:22 INFO - PROCESS | 23994 | 13:31:22 INFO - PROCESS | 23994 | [#0] ai-astar Cycles:10 Average:108.10 Median:110.00 stddev:4.12 (3.7%) stddev-sans-first:4.31 13:31:22 INFO - PROCESS | 23994 | Values: 110.0 109.0 104.0 109.0 111.0 110.0 98.0 109.0 109.0 112.0 13:31:22 INFO - PROCESS | 23994 | 13:31:22 INFO - PROCESS | 23994 | [#1] audio-beat-detection Cycles:10 Average:149.20 Median:157.50 stddev:18.09 (11.5%) stddev-sans-first:19.02 13:31:22 INFO - PROCESS | 23994 | Values: 156.0 127.0 161.0 165.0 131.0 152.0 159.0 127.0 179.0 135.0 13:31:22 INFO - PROCESS | 23994 | 13:31:22 INFO - PROCESS | 23994 | [#2] audio-dft Cycles:10 Average:161.30 Median:161.00 stddev:1.42 (0.9%) stddev-sans-first:1.50 13:31:22 INFO - PROCESS | 23994 | Values: 161.0 161.0 161.0 161.0 161.0 162.0 160.0 165.0 160.0 161.0 13:31:22 INFO - PROCESS | 23994 | 13:31:22 INFO - PROCESS | 23994 | [#3] audio-fft Cycles:10 Average:93.60 Median:76.00 stddev:35.61 (46.9%) stddev-sans-first:37.20 13:31:22 INFO - PROCESS | 23994 | Values: 76.0 77.0 83.0 161.0 77.0 76.0 73.0 76.0 161.0 76.0 13:31:22 INFO - PROCESS | 23994 | 13:31:22 INFO - PROCESS | 23994 | [#4] audio-oscillator Cycles:10 Average:107.80 Median:93.00 stddev:23.85 (25.6%) stddev-sans-first:24.68 13:31:22 INFO - PROCESS | 23994 | Values: 93.0 93.0 142.0 93.0 92.0 94.0 144.0 93.0 93.0 141.0 13:31:22 INFO - PROCESS | 23994 | 13:31:22 INFO - PROCESS | 23994 | [#5] imaging-gaussian-blur Cycles:10 Average:116.80 Median:117.00 stddev:0.42 (0.4%) stddev-sans-first:0.44 13:31:22 INFO - PROCESS | 23994 | Values: 117.0 117.0 117.0 117.0 117.0 117.0 116.0 117.0 117.0 116.0 13:31:22 INFO - PROCESS | 23994 | 13:31:22 INFO - PROCESS | 23994 | [#6] imaging-darkroom Cycles:10 Average:146.20 Median:146.50 stddev:0.79 (0.5%) stddev-sans-first:0.78 13:31:22 INFO - PROCESS | 23994 | Values: 147.0 146.0 146.0 146.0 147.0 145.0 146.0 147.0 147.0 145.0 13:31:22 INFO - PROCESS | 23994 | 13:31:22 INFO - PROCESS | 23994 | [#7] imaging-desaturate Cycles:10 Average:95.30 Median:95.00 stddev:0.48 (0.5%) stddev-sans-first:0.50 13:31:22 INFO - PROCESS | 23994 | Values: 95.0 95.0 95.0 96.0 96.0 95.0 95.0 95.0 96.0 95.0 13:31:22 INFO - PROCESS | 23994 | 13:31:22 INFO - PROCESS | 23994 | [#8] json-parse-financial Cycles:10 Average:55.70 Median:55.50 stddev:3.37 (6.1%) stddev-sans-first:3.52 13:31:22 INFO - PROCESS | 23994 | Values: 54.0 54.0 56.0 56.0 55.0 54.0 60.0 63.0 53.0 52.0 13:31:22 INFO - PROCESS | 23994 | 13:31:22 INFO - PROCESS | 23994 | [#9] json-stringify-tinderbox Cycles:10 Average:67.20 Median:67.00 stddev:1.75 (2.6%) stddev-sans-first:1.80 13:31:22 INFO - PROCESS | 23994 | Values: 66.0 67.0 72.0 66.0 67.0 67.0 66.0 67.0 67.0 67.0 13:31:22 INFO - PROCESS | 23994 | 13:31:22 INFO - PROCESS | 23994 | [#10] stanford-crypto-aes Cycles:10 Average:80.80 Median:81.00 stddev:0.79 (1.0%) stddev-sans-first:0.50 13:31:22 INFO - PROCESS | 23994 | Values: 79.0 81.0 82.0 81.0 81.0 81.0 81.0 80.0 81.0 81.0 13:31:22 INFO - PROCESS | 23994 | 13:31:22 INFO - PROCESS | 23994 | [#11] stanford-crypto-ccm Cycles:10 Average:114.40 Median:114.00 stddev:3.44 (3.0%) stddev-sans-first:3.54 13:31:22 INFO - PROCESS | 23994 | Values: 112.0 112.0 114.0 112.0 112.0 115.0 114.0 123.0 117.0 113.0 13:31:22 INFO - PROCESS | 23994 | 13:31:22 INFO - PROCESS | 23994 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:143.60 Median:146.00 stddev:8.25 (5.6%) stddev-sans-first:8.66 13:31:22 INFO - PROCESS | 23994 | Values: 147.0 144.0 148.0 135.0 157.0 133.0 135.0 138.0 154.0 145.0 13:31:22 INFO - PROCESS | 23994 | 13:31:22 INFO - PROCESS | 23994 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:66.90 Median:67.00 stddev:1.10 (1.6%) stddev-sans-first:1.17 13:31:22 INFO - PROCESS | 23994 | Values: 67.0 68.0 68.0 66.0 66.0 67.0 66.0 69.0 66.0 66.0 13:31:22 INFO - PROCESS | 23994 | -------- Summary: end -------- 13:31:22 INFO - PROCESS | 23994 | 13:31:23 INFO - TEST-INFO | 23994: exit 0 13:31:23 INFO - TEST-OK | kraken | took 59941ms 13:31:23 INFO - SUITE-END | took 1171s 13:31:23 INFO - Completed test suite (00:19:32) 13:31:23 INFO - javascript benchmark 13:31:23 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"lowerIsBetter": false, "subtests": [{"lowerIsBetter": false, "replicates": [3294.4893541501065, 3307.2393349529593, 3373.865045398184, 3376.27410106827, 3410.931781364373, 5389.191621256813, 5400.081986062369, 5405.972970135143, 5427.0773968425365, 5460.426655201206, 5392.137258038714, 5394.514493695567, 5425.430329815372, 5431.646942948715, 5431.83704488865, 4748.833790817322, 4930.6302027348, 4976.552110310071, 4992.825251116212, 5031.4465408805, 4926.605871530269, 5017.422996355411, 5019.347484826967, 5019.874503137433, 5023.497650234984, 4908.43552991407, 4981.9252711209365, 5015.924761128586, 5033.748312584375, 5056.19100943849, 5042.495750424965, 5048.444671086178, 5060.974695126538, 5068.898622027539, 5116.1302578561545, 4818.590419814285, 4872.537108974641, 4939.209726443752, 4954.281629163751, 4971.1549036663855, 5307.893842123136, 5348.251244825728, 5350.3312085989255, 5352.384475785296, 5376.865578360573, 5687.573431992617, 5770.711464426762, 5834.358220595731, 5865.882682346371, 5882.647041177543, 5802.506786923117, 5844.386339434341, 5872.882542349172, 5882.176495290662, 5900.822975310747, 5472.616916815825, 5474.42518535552, 5479.726013699299, 5488.69812160327, 5491.121420572689, 5855.209546711225, 5943.435373639497, 5991.64050156992, 6010.909836352458, 6032.819015429544, 5790.247267855236, 5807.12893066035, 5807.303123625107, 5808.506276966421, 5815.331236907809, 5866.501347385435, 5879.676617785977, 5884.264466941632, 5884.9705751470965, 5886.558508111909, 5683.829485115453, 5733.627314224562, 5797.652140871562, 5817.0983497557945, 5847.26909136358, 5745.109508026179, 5754.4533269339345, 5758.452946970031, 5759.424057594207, 5768.4808367246305, 4371.344298355272, 4399.560043995639, 4407.4050003249795, 4407.845725399596, 4433.224185767478, 3861.7489863158803, 3971.523417189898, 4008.7995600219874, 4027.35562310029, 4061.3704875744306, 5418.810341638024, 5425.050616142159, 5440.156775699773, 5459.754311056012, 5486.807961721321, 5714.514266287329, 5775.48020678141, 5793.7392817323325, 5796.710164491758, 5796.855078623068, 5438.0, 5468.28912241414, 5493.395726470085, 5503.394626591072, 5518.365387980433, 4997.350344455198, 5031.4465408805, 5037.11850426174, 5040.873978150576, 5065.493450654905, 5801.9419805802245, 5997.55018373615, 6049.758009679564, 6065.211522502046, 6066.029435290332, 5800.042992906292, 5848.356680765198, 5851.678157701367, 5852.326982397079, 5862.325832529314, 5992.370801065999, 6004.819855404345, 6012.398760123952, 6012.549058820693, 6015.157877897011, 5660.094384898396, 5753.712314384347, 5777.364489906191, 5781.046127388934, 5788.971055144697, 5888.028475301699, 5888.381719919518, 5897.439743224387, 5897.734601942837, 5900.616459930091, 5678.0631195853875, 5717.942820571908, 5726.513246374105, 5732.856678583069, 5744.454276843693, 5585.134304182858, 5623.746931388016, 5704.771809127588, 5747.885042299047, 5778.94221057784, 5660.349059858005, 5673.914891276551, 5705.429457054262, 5709.058005429058, 5715.171300161536, 5800.477956983892, 5816.302043754777, 5823.883522329615, 5831.008728516078, 5834.533237340917, 5478.397376288525, 5478.808241711521, 5610.971945140248, 5650.886982260414, 5683.460071293221], "unit": "score", "name": "dojo.html", "value": 5383.776706503244}, {"lowerIsBetter": false, "replicates": [564.5822091652178, 571.3229822660148, 583.9065749480083, 596.8209537138857, 658.8879890418629, 31977.52033719496, 39095.80452097739, 39491.80254098726, 39492.0, 39636.60363396365, 42683.78658106705, 43003.13993720124, 43091.56908430922, 43391.78304108483, 43435.0, 8772.122787721224, 8965.372423930328, 8975.551222438884, 8981.0, 8981.910180898172, 8749.256313213384, 8904.955475222614, 8908.554572271392, 8911.821763564725, 9125.908740912571, 9088.091190880892, 9185.770355741126, 9187.26501879848, 9195.12646298604, 9203.447793132433, 9124.224440922497, 9213.585388657526, 9225.169734723908, 9230.815383692356, 9232.723018309462, 9068.546572671406, 9212.263018958467, 9216.0, 9217.631294748202, 9219.308551858638, 42866.35700464495, 43014.78492607548, 43316.350254746205, 43487.565124348665, 43530.564694352965, 3706.3513885070274, 3706.666400023984, 3861.4400911867624, 4046.3930410438375, 4229.577042295777, 28899.897743405327, 29416.11751647454, 30931.845340773376, 31432.842835785905, 31729.206769830707, 4221.472315960505, 4296.5273819879785, 4304.892377690551, 4337.609615134653, 4378.1462614790125, 301969.0, 305127.0, 306324.0, 306670.0, 308472.0, 67898.66050669814, 68760.0, 68772.31227687659, 68828.6558567214, 68832.6558367205, 73637.0, 74508.62745686236, 74596.25403746002, 74672.62663686647, 74753.62623186849, 17691.469255922344, 17841.107944602718, 17918.731219031724, 17933.37233196832, 17952.371666991592, 13638.454461821417, 13817.930910345585, 13819.239941803096, 13821.585352439442, 13827.0, 22589.77410225877, 23308.533829323318, 23369.182078627167, 23454.530909381716, 23547.646785298235, 7889.802754931058, 8015.957925469768, 8251.257386835214, 8447.873281900776, 8580.442271252348, 1089.6404186618397, 1091.8089334366614, 1126.8197088465806, 1146.747715502588, 1221.2428294457493, 28658.713412866022, 29034.0, 29050.7094929048, 29079.418411632072, 29340.119796406143, 1129.593346395297, 1161.1407558406718, 1227.5274019502376, 1247.3638444393425, 1284.877936596022, 15096.622584435258, 15382.153981530899, 15595.454159104604, 15829.445969391016, 15898.125603091941, 369821.0, 373788.0, 373873.0, 374380.0, 375004.0, 57641.13538296929, 58102.0, 58155.418445815, 58165.12752308719, 58258.70870645619, 1361.5438827992534, 1449.3984996226447, 1469.3167677030233, 1488.1071357185817, 1501.14434772181, 27178.0, 28952.710472895, 29571.556426653187, 29681.25796855096, 29856.0, 46945.765271173426, 54920.176197356275, 55891.0, 55986.160207597735, 55986.72006639941, 303626.0, 310833.0, 313289.0, 313754.0, 319379.0, 40001.59998399979, 49884.25173622471, 51445.0, 51552.74223628858, 52211.73894130657, 47194.29208561806, 47687.0, 47851.52148478471, 48469.75765121152, 48709.26936096032, 42156.0, 42347.0, 42634.5736542643, 42724.0, 43782.781086094365, 41315.38026929538, 41571.37642935419, 41659.7917010413, 41920.580794191665, 43062.13875722531, 43339.56660433482, 43529.34705979476, 43903.34144987891, 44255.77872110619, 44379.33430998473, 33744.66255337415, 37971.240575188895, 38133.618663814115, 38303.04242393851, 38519.614803851604, 27359.72640273572, 27971.0, 28130.85934570396, 28182.577261340688, 28281.858590706914], "unit": "score", "name": "ext.html", "value": 20550.48069358695}, {"lowerIsBetter": false, "replicates": [384.93840985442336, 385.9884203473896, 388.33206884159245, 398.4382021349895, 399.7641391578968, 14462.349194286257, 16628.939491607583, 17400.0, 18690.0, 18790.436286911397, 16916.492505224833, 17317.7402338965, 17372.56568585783, 17933.103344832773, 17944.82055179451, 5336.17289320155, 5361.919571206435, 5535.418781027995, 5553.444655534455, 5580.107182850745, 5485.067538518461, 5526.668399895999, 5567.610267281292, 5571.777128914839, 5572.916406253889, 5521.0, 5561.499465048145, 5617.775288988436, 5617.8033768818095, 5626.071698169797, 5473.959947609961, 5591.692456914909, 5632.633878797906, 5633.183188437674, 5637.915431268534, 5035.647504674675, 5045.899082018375, 5046.21783623539, 5047.293378926953, 5048.596112311006, 21287.787122128735, 21566.460838479165, 21847.235346762947, 21859.781402185934, 22133.446663833533, 2425.9810879430684, 2497.0, 2599.7790187834057, 2909.7526710229654, 2936.3540021195304, 13471.124376915566, 13478.0, 13762.724745505035, 14126.505572305023, 14267.500637477639, 1880.4452686457528, 1922.3944457495843, 1940.2723978508059, 1949.8732582382243, 1966.8721533100302, 62962.37037629657, 63319.0, 63591.6820415895, 63760.0, 64436.67781661109, 9831.705048848546, 10080.69757907264, 10179.491025448699, 10235.027672371112, 10254.0, 12654.87345126537, 13017.21896686202, 14424.423023079169, 14449.277536123152, 14450.205238711762, 7433.182349941502, 7595.620218989028, 7967.322777563856, 7977.441579089408, 8084.3936704747375, 7843.215678432111, 7912.960435197787, 7951.920480795234, 7953.284204421514, 7960.084590272077, 6023.578349515579, 6085.665288409092, 6122.755089796358, 6127.540434467343, 6197.070439434031, 1883.5385330594092, 1890.3478299986482, 1896.5163883209693, 1915.1669023974616, 1919.1459800388693, 486.5159166629227, 984.8375018122073, 1022.3456987527989, 1063.6657164320936, 1082.929609575375, 10998.450077496253, 11553.537858485735, 11644.24312419707, 11674.416279186007, 11748.353840538852, 479.8512461137059, 486.4527406667499, 491.1870853737071, 514.108022580822, 524.1587252459823, 6143.56995010354, 6355.332690067568, 6370.84072898172, 6380.202474690664, 6424.0, 454964.0, 455985.0, 470628.0, 476028.0, 480316.0, 80450.0, 82143.5892820544, 82719.0, 82969.58515207385, 83692.0, 497.84815631232823, 506.2861365474737, 510.2626704412163, 1024.2011231239644, 1056.7596695006634, 15100.622484437537, 15309.311081001159, 15345.769813452584, 15485.458008969632, 15744.29150688199, 32014.199645008128, 33480.0, 35579.82210088933, 36087.819560902026, 36542.0, 46467.3029904545, 47145.528544714114, 47576.0, 48185.75907120442, 48203.0, 8059.153788852086, 8110.83778324442, 8118.775414723558, 8222.218889205516, 8487.872681909652, 6687.465002799861, 7780.84438311242, 8997.55012249398, 9565.612986116836, 9988.850167247352, 10240.283180177315, 10293.073623373932, 10355.689329320132, 10654.414007229676, 11101.11191104726, 9916.851247231441, 10099.343542669703, 10589.417582033062, 10698.251122421356, 11059.557617695202, 9420.764480888032, 9989.150922171406, 10437.530311135864, 10597.311174773615, 10775.030247277782, 7944.245296696805, 7951.443398962017, 8197.385196110436, 8222.259996600334, 8275.255227029596, 9110.863337050083, 10095.798084038424, 10427.374357538572, 10676.946615266874, 10692.19808514349], "unit": "score", "name": "jquery.html", "value": 8225.853848682596}, {"lowerIsBetter": false, "replicates": [1395.372082562847, 1569.9843001569984, 1588.5155027716546, 1812.7280907863826, 1959.46114818425, 8000.199980002004, 8128.065272493665, 8173.754787356382, 8185.140560241178, 8192.54940978246, 8336.874946875801, 8489.617967191476, 8500.787480312994, 8507.829843403128, 8513.829723405528, 2120.968185477219, 2375.5486457573047, 2391.282615215437, 2406.1458182345277, 2433.452473193535, 2427.1262345555588, 2434.926952191437, 2436.2691192642224, 2437.5003124359464, 2438.634204869266, 2338.8830558472096, 2402.795762360193, 2404.831661783676, 2408.6025805742033, 2409.5301416223842, 2414.927552173429, 2416.2871952773976, 2459.7786199242064, 2462.0, 2467.494163696438, 2401.591729406005, 2402.0992127952018, 2425.7331693513697, 2481.4788894332214, 2482.1064416809936, 8611.0, 8657.0, 8658.04761476237, 8669.739907802776, 8670.783230419227, 5163.40620828602, 5310.070737620901, 5350.3312085989255, 5350.438203988564, 5358.892822143535, 3245.334706385185, 3268.934621307584, 3303.9834800826084, 3375.780574262665, 3395.066356751888, 968.5689868008739, 973.7030205787232, 981.2395393569969, 993.1409330928694, 1002.8044531316397, 12017.879821201763, 12047.277163370225, 12047.819282710767, 12052.638420847388, 12056.578019769353, 4518.118966801508, 4741.2414013758325, 4759.619230461555, 4765.785539650724, 4774.641901857374, 10235.0, 10278.0, 10290.279680422298, 10291.639792607222, 10301.175905927657, 4692.319613656001, 5197.402298735618, 5259.289995850511, 5389.245505629215, 5393.110136827379, 4696.577308042292, 4734.337192793012, 4774.689645173053, 4776.331313616097, 4777.0684716479955, 3802.8478860845257, 3859.073822282688, 3911.1395492991496, 3916.6083391661177, 3945.1715139820385, 1234.1361047266948, 1293.9935300323439, 1303.7718399280088, 1314.073578127418, 1316.0984725463088, 1356.9118007329491, 1369.8493165751759, 1387.1122481611776, 1429.0496819615048, 1445.2123592642035, 8095.635696393676, 8134.59327033646, 8152.062512811102, 8164.101948785629, 8179.67281308741, 502.88433660258346, 508.8015673887187, 515.0548743056534, 516.8268630008914, 519.6284656470642, 5992.700364981733, 6027.969860150672, 6028.517718582503, 6042.818715438544, 6083.330833608299, 10041.447720375303, 10155.543000564992, 10240.590376384862, 10256.12822910061, 10377.584896604052, 9926.851097233548, 10091.646792362379, 10126.696199114038, 10127.848082278771, 10166.4916754162, 8029.879551806727, 8144.389170812213, 8247.835043299221, 8248.917510824815, 8256.422050456411, 7958.562279074475, 8028.718994835386, 8053.194680532134, 8160.347172226327, 8172.427930045078, 9116.908830911607, 9164.495952722664, 9234.861477077984, 9249.12133347331, 9353.625854965725, 9142.314326425412, 9408.29437792182, 9561.37851039708, 9575.712728618153, 9604.279679024241, 6783.491238157059, 7133.500654954103, 7313.524620899837, 7507.587082710504, 7641.579713115832, 8165.714200002972, 8166.510009399218, 8178.059523154675, 8199.508029518249, 8199.631016604386, 7135.322144396274, 7373.410127189704, 7409.8147546311775, 7620.0, 7638.618069096634, 7323.7436689715605, 7394.889076663747, 7470.925290747023, 7479.813004674927, 7550.584717840571, 7789.260020298063, 7820.804479888048, 7832.099308579586, 7847.882281765664, 7873.448858579844, 7088.04311417952, 7117.857642847218, 7159.642017899188, 7165.570065796069, 7209.0628218331285, 7308.96345518269, 7309.926900730925, 7341.045664063638, 7363.926360736324, 7368.668409921459], "unit": "score", "name": "mootools.html", "value": 4779.826205506356}, {"lowerIsBetter": false, "replicates": [360.8069682719745, 362.6699703270023, 363.4439307858975, 364.1805936642554, 371.6209466344327, 6022.969885150574, 6045.7883974060915, 6067.575269731126, 6069.059295809146, 6075.817725468232, 6007.158997740309, 6007.639541627505, 6024.0, 6026.849328766783, 6035.486983606388, 4472.396226509412, 4546.454425468948, 4587.518310577391, 4650.813967441315, 4698.765061746916, 4616.746078965655, 4638.165130276549, 4638.466576343713, 4645.372874661928, 4650.348951146842, 4597.310403439477, 4602.355670206174, 4605.608523275526, 4609.354690343354, 4612.0775844831, 4445.755483448409, 4554.089182163564, 4610.585047345755, 4621.19129152397, 4635.11932732783, 4115.36211887158, 4119.279126152941, 4136.8138433770555, 4138.0689344897455, 4144.7513149210845, 5715.457031581993, 5722.513586345166, 5725.742341594639, 5736.196932429463, 5738.139279108125, 5476.452354764531, 5480.671159730389, 5481.095619222863, 5487.560995120421, 5489.725513724298, 6367.267764207129, 6387.201599800025, 6387.977923532212, 6389.424951754364, 6396.840078998062, 4309.870703878889, 4442.600165985044, 4450.310201918675, 4492.61812745917, 4601.953980460219, 6566.835829104263, 6618.933810661928, 6631.767888123893, 6632.237292711352, 6642.468602511739, 4550.726956382628, 4570.611498022706, 4574.153781550423, 4579.061292435043, 4588.105319462673, 4640.025594625166, 4648.093621743795, 4648.418947631546, 4649.372334734768, 4655.138799322136, 5345.946540534623, 5352.384475785257, 5354.30394048779, 5367.973160134175, 5371.167469042305, 6279.3720627937755, 6329.525285603506, 6398.8720225595225, 6400.839979000469, 6404.807855764335, 1624.1310898669392, 1631.4616176661673, 1633.4527933142292, 1637.2059551117698, 1640.097946129624, 1032.4734385463469, 1071.3571856885806, 1078.2344535379968, 1100.9559617615205, 1102.9889701103048, 6011.1884895539415, 6014.969925150346, 6017.308009578867, 6020.337762846083, 6022.45797878193, 6397.6801159941815, 6419.775307864203, 6516.283208847023, 6517.837054073591, 6534.673266336759, 6090.451859332681, 6109.389061093855, 6112.297085835097, 6115.724792384353, 6116.266048074171, 3473.913152171216, 3493.703035241982, 3511.596166440841, 3511.9297614048087, 3522.383582872987, 6599.505037122139, 6714.362135597111, 6847.0, 6898.206706228848, 6904.378605925491, 6825.283345248777, 6838.042674025641, 6838.589684618939, 6847.417969472551, 6848.246692863781, 6871.244163142051, 6883.036374907517, 6888.207856096513, 6890.896636550456, 6896.586204827626, 6636.7013484392355, 6641.900371494528, 6643.40209381158, 6645.60126392418, 6649.933500665125, 6437.555907589417, 6501.187351580863, 6574.901376479261, 6575.112359831362, 6585.3085426029575, 6815.318468153145, 6851.520393572402, 6855.760048398282, 6862.862742745217, 6869.519133660596, 4580.67935244543, 4630.490646028867, 4634.189016922092, 4637.466691330405, 4640.095181439587, 6637.900431493435, 6659.467242620675, 6693.966530167318, 6713.060171575886, 6729.495287853332, 6343.397377249154, 6441.420272175526, 6458.644774537445, 6474.514411419256, 6488.513361497812, 6429.710663020269, 6450.451711604566, 6460.063290822711, 6462.676866156579, 6483.837904052436, 6321.146645203023, 6339.683015849281, 6340.682965851597, 6343.080253363144, 6351.936480635134, 6450.129232553545, 6485.708143133476, 6487.18910136233, 6500.382463665944, 6511.446527045065, 6061.242344706911, 6181.690915454299, 6338.651374174465, 6358.395952384516, 6358.936410635834], "unit": "score", "name": "prototype.html", "value": 4850.959250891715}, {"lowerIsBetter": false, "replicates": [745.1728581274784, 747.3162056718099, 753.3935182178344, 883.9071897450767, 895.3553441522106, 13866.029377943549, 13990.650233744162, 14010.859891401084, 14020.859791402083, 14022.649433764162, 13059.0, 13157.079004469691, 13170.078094533386, 13171.736565268713, 13196.604101876936, 772.3589420780738, 927.7263207353847, 939.4598106088991, 942.7501712046313, 943.9852158929144, 944.8393773058597, 946.0208684012049, 953.7377221264138, 953.828310904037, 954.341504361988, 826.4627991805314, 980.7891303369775, 980.8234517786796, 980.9705708828711, 981.293468702533, 976.2287792643803, 984.3847595252967, 984.8571957066185, 986.7878406142678, 987.1559816356984, 728.155339805828, 730.3645828129509, 730.9634518274065, 731.1883808972037, 731.849970755999, 14286.642833929234, 14319.069260498034, 14328.283585820667, 14332.57002289933, 14364.64088397788, 13528.526501572398, 13762.65593360174, 13930.442782288696, 13981.35951782218, 14274.072185307921, 10338.7415314617, 10473.0, 10495.475226238657, 10588.364698118137, 10776.245662803607, 3537.5401197844117, 3586.9282614347826, 3603.279344131158, 3653.324135035027, 3708.42519409492, 51102.488975110144, 51164.0, 51278.487215127745, 51789.99999999962, 52148.0, 10766.73083172927, 10963.83554246687, 11124.443777811077, 11162.832557511643, 11603.129765267639, 20716.171353145706, 20748.066337014872, 20758.377248682562, 20772.169113235603, 20817.89591052035, 7703.268189521987, 7745.302922736981, 7877.527348359117, 7892.408069394818, 7989.920100798918, 4347.913041739147, 4408.7575183365225, 4471.396361491222, 4548.408706868152, 4754.096721622881, 3352.513885486591, 3378.4256676365076, 3386.2888793353673, 3388.9830550847087, 3390.593128824557, 549.9092649712833, 572.7508533787816, 572.894014607299, 574.6925394913701, 584.564499447914, 675.1965161457849, 678.2268214235775, 684.9041134241211, 695.655650453029, 716.5736386849816, 8064.395170362129, 8101.189881011852, 8287.461315014505, 8354.206350396702, 8537.658493660309, 657.5824351536713, 662.5726406467801, 673.5882753851726, 688.5042769206163, 692.7229108356597, 3833.386658134685, 3867.207222519377, 3867.651911327994, 3972.8013599320498, 3975.284448799244, 54526.0, 56351.43648563544, 56968.430315697144, 57344.0, 57705.0, 50280.0, 50375.0, 50488.0, 50995.0, 50998.49001509937, 45604.54395456003, 45682.771586141855, 46466.76766616145, 46483.0, 47252.76373618178, 8176.509409435215, 8221.958890205511, 8529.786755331166, 8542.701005464778, 8547.316214702685, 32336.83831580921, 32465.51301730523, 33318.0, 33664.0, 33877.83061084679, 37807.43288850725, 37916.0, 43379.566204337556, 44194.558054419045, 45401.545984539734, 11480.253783504046, 11507.482163302504, 11867.821982670093, 12461.439235234255, 12501.874981250072, 11369.03363214103, 11761.941190294336, 11823.11326650522, 11997.040236780862, 12084.637460876187, 11283.153763467608, 11433.314001159957, 11558.364289964133, 11645.126615503701, 11905.692972512978, 10531.285721385739, 10616.34591352162, 10667.199960002876, 10741.677749667522, 10834.187435942493, 10635.415052172204, 10857.239993200401, 11246.550137994389, 11411.942940285246, 11546.307221566733, 8993.640254390013, 9235.538223088684, 9265.861012084959, 9675.371100878421, 9908.25688073383, 9298.395604285699, 9361.953190234006, 9396.812063758549, 9504.857427138737, 9523.380980236263], "unit": "score", "name": "yui.html", "value": 6528.597895875277}], "name": "dromaeo_css", "value": 7186.731675900743}, {"lowerIsBetter": true, "subtests": [{"lowerIsBetter": true, "replicates": [110.0, 109.0, 104.0, 109.0, 111.0, 110.0, 98.0, 109.0, 109.0, 112.0], "unit": "score", "name": "ai-astar", "value": 108.1}, {"lowerIsBetter": true, "replicates": [156.0, 127.0, 161.0, 165.0, 131.0, 152.0, 159.0, 127.0, 179.0, 135.0], "unit": "score", "name": "audio-beat-detection", "value": 149.2}, {"lowerIsBetter": true, "replicates": [161.0, 161.0, 161.0, 161.0, 161.0, 162.0, 160.0, 165.0, 160.0, 161.0], "unit": "score", "name": "audio-dft", "value": 161.3}, {"lowerIsBetter": true, "replicates": [76.0, 77.0, 83.0, 161.0, 77.0, 76.0, 73.0, 76.0, 161.0, 76.0], "unit": "score", "name": "audio-fft", "value": 93.6}, {"lowerIsBetter": true, "replicates": [93.0, 93.0, 142.0, 93.0, 92.0, 94.0, 144.0, 93.0, 93.0, 141.0], "unit": "score", "name": "audio-oscillator", "value": 107.8}, {"lowerIsBetter": true, "replicates": [117.0, 117.0, 117.0, 117.0, 117.0, 117.0, 116.0, 117.0, 117.0, 116.0], "unit": "score", "name": "imaging-gaussian-blur", "value": 116.8}, {"lowerIsBetter": true, "replicates": [147.0, 146.0, 146.0, 146.0, 147.0, 145.0, 146.0, 147.0, 147.0, 145.0], "unit": "score", "name": "imaging-darkroom", "value": 146.2}, {"lowerIsBetter": true, "replicates": [95.0, 95.0, 95.0, 96.0, 96.0, 95.0, 95.0, 95.0, 96.0, 95.0], "unit": "score", "name": "imaging-desaturate", "value": 95.3}, {"lowerIsBetter": true, "replicates": [54.0, 54.0, 56.0, 56.0, 55.0, 54.0, 60.0, 63.0, 53.0, 52.0], "unit": "score", "name": "json-parse-financial", "value": 55.7}, {"lowerIsBetter": true, "replicates": [66.0, 67.0, 72.0, 66.0, 67.0, 67.0, 66.0, 67.0, 67.0, 67.0], "unit": "score", "name": "json-stringify-tinderbox", "value": 67.2}, {"lowerIsBetter": true, "replicates": [79.0, 81.0, 82.0, 81.0, 81.0, 81.0, 81.0, 80.0, 81.0, 81.0], "unit": "score", "name": "stanford-crypto-aes", "value": 80.8}, {"lowerIsBetter": true, "replicates": [112.0, 112.0, 114.0, 112.0, 112.0, 115.0, 114.0, 123.0, 117.0, 113.0], "unit": "score", "name": "stanford-crypto-ccm", "value": 114.4}, {"lowerIsBetter": true, "replicates": [147.0, 144.0, 148.0, 135.0, 157.0, 133.0, 135.0, 138.0, 154.0, 145.0], "unit": "score", "name": "stanford-crypto-pbkdf2", "value": 143.6}, {"lowerIsBetter": true, "replicates": [67.0, 68.0, 68.0, 66.0, 66.0, 67.0, 66.0, 69.0, 66.0, 66.0], "unit": "score", "name": "stanford-crypto-sha256-iterative", "value": 66.9}], "name": "kraken", "value": 1506.8999999999999}]} 13:31:23 INFO - Return code: 0 13:31:23 INFO - Validating PERFHERDER_DATA against /builds/slave/test/build/tests/talos/treeherder-schemas/performance-artifact.json 13:31:23 INFO - # TBPL SUCCESS # 13:31:23 INFO - Running post-action listener: _resource_record_post_action 13:31:23 INFO - Running post-run listener: _resource_record_post_run 13:31:24 INFO - Total resource usage - Wall time: 1188s; CPU: 13.0%; Read bytes: 0; Write bytes: 496848896; Read time: 0; Write time: 437556 13:31:24 INFO - install - Wall time: 16s; CPU: 14.0%; Read bytes: 0; Write bytes: 244908032; Read time: 0; Write time: 272092 13:31:24 INFO - run-tests - Wall time: 1173s; CPU: 13.0%; Read bytes: 0; Write bytes: 251940864; Read time: 0; Write time: 165464 13:31:24 INFO - Running post-run listener: _upload_blobber_files 13:31:24 INFO - Blob upload gear active. 13:31:24 INFO - Preparing to upload files from /builds/slave/test/build/blobber_upload_dir. 13:31:24 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 13:31:24 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'] 13:31:24 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 13:31:24 INFO - (blobuploader) - INFO - Open directory for files ... 13:31:24 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log ... 13:31:24 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 13:31:24 INFO - (blobuploader) - INFO - Uploading, attempt #1. 13:31:25 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs_errorsummary.log: uploaded 13:31:25 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 13:31:25 INFO - (blobuploader) - INFO - Done attempting. 13:31:25 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log ... 13:31:25 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 13:31:25 INFO - (blobuploader) - INFO - Uploading, attempt #1. 13:31:26 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs_raw.log: uploaded 13:31:26 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 13:31:26 INFO - (blobuploader) - INFO - Done attempting. 13:31:26 INFO - (blobuploader) - INFO - Iteration through files over. 13:31:26 INFO - Return code: 0 13:31:26 INFO - rmtree: /builds/slave/test/build/uploaded_files.json 13:31:26 INFO - retry: Calling remove with args: ('/builds/slave/test/build/uploaded_files.json',), kwargs: {}, attempt #1 13:31:26 INFO - Setting buildbot property blobber_files to {"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/2e6b20dce65960cc1d819f715722204dbf05af876e3a205423ef7b96dd7cf01d0a65471f270cb122bed7b1e2da761cb9e10e150b49bc9fc61dfc4ac9ff836483", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/14c526881ae62636aca689607496eacd9c32f5141093026fea81009a71f8eb82a9d6157e813af73c3e7e80f28600cf4d38b1373b6511a019e2abcc6dd3fe4626"} 13:31:26 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test/properties/blobber_files 13:31:26 INFO - Writing to file /builds/slave/test/properties/blobber_files 13:31:26 INFO - Contents: 13:31:26 INFO - blobber_files:{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/2e6b20dce65960cc1d819f715722204dbf05af876e3a205423ef7b96dd7cf01d0a65471f270cb122bed7b1e2da761cb9e10e150b49bc9fc61dfc4ac9ff836483", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/14c526881ae62636aca689607496eacd9c32f5141093026fea81009a71f8eb82a9d6157e813af73c3e7e80f28600cf4d38b1373b6511a019e2abcc6dd3fe4626"} 13:31:26 INFO - Running post-run listener: copy_logs_to_upload_dir 13:31:26 INFO - Copying logs to upload dir... 13:31:26 INFO - mkdir: /builds/slave/test/build/upload/logs 13:31:26 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1251.798651 ========= master_lag: 0.02 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 51 secs) (at 2016-04-24 13:31:25.712460) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-04-24 13:31:25.720377) ========= bash -c 'for file in `ls -1`; do cat $file; done' in dir /builds/slave/test/properties (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', 'for file in `ls -1`; do cat $file; done'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test/properties SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=934fc3100db09dcb9af4d4b6000001ab-1461528399.567872-973537465 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False blobber_files:{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/2e6b20dce65960cc1d819f715722204dbf05af876e3a205423ef7b96dd7cf01d0a65471f270cb122bed7b1e2da761cb9e10e150b49bc9fc61dfc4ac9ff836483", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/14c526881ae62636aca689607496eacd9c32f5141093026fea81009a71f8eb82a9d6157e813af73c3e7e80f28600cf4d38b1373b6511a019e2abcc6dd3fe4626"} build_url:https://queue.taskcluster.net/v1/task/Ffpw445VShOp2q0DdGojNg/artifacts/public/build/firefox-47.0a2.en-US.linux-x86_64.tar.bz2 program finished with exit code 0 elapsedTime=0.011252 build_url: 'https://queue.taskcluster.net/v1/task/Ffpw445VShOp2q0DdGojNg/artifacts/public/build/firefox-47.0a2.en-US.linux-x86_64.tar.bz2' blobber_files: '{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/2e6b20dce65960cc1d819f715722204dbf05af876e3a205423ef7b96dd7cf01d0a65471f270cb122bed7b1e2da761cb9e10e150b49bc9fc61dfc4ac9ff836483", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/14c526881ae62636aca689607496eacd9c32f5141093026fea81009a71f8eb82a9d6157e813af73c3e7e80f28600cf4d38b1373b6511a019e2abcc6dd3fe4626"}' ========= master_lag: 0.01 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-04-24 13:31:25.745887) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-04-24 13:31:25.746196) ========= rm -f oauth.txt in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['rm', '-f', 'oauth.txt'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=934fc3100db09dcb9af4d4b6000001ab-1461528399.567872-973537465 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004492 ========= master_lag: 0.08 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-04-24 13:31:25.826504) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2016-04-24 13:31:25.826799) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2016-04-24 13:31:25.827925) ========= ========= Total master_lag: 0.19 =========