builder: fx-team_ubuntu64_hw_test-dromaeojs-e10s slave: talos-linux64-ix-059 starttime: 1452719250.38 results: success (0) buildid: 20160113122832 builduid: c1f7e108569e40fb83b46a6d996a6e9f revision: 3a531aa40e497499331f462fad9349201c9d7d98 ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2016-01-13 13:07:30.383470) ========= master: http://buildbot-master105.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2016-01-13 13:07:30.383997) ========= ========= Started set props: basedir (results: 0, elapsed: 0 secs) (at 2016-01-13 13:07:30.384338) ========= bash -c pwd in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', 'pwd'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=3a3620fb28aea1604ab609ef000001d2-1452719001.9378-1378824880 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False /builds/slave/test program finished with exit code 0 elapsedTime=0.006322 basedir: '/builds/slave/test' ========= master_lag: 0.02 ========= ========= Finished set props: basedir (results: 0, elapsed: 0 secs) (at 2016-01-13 13:07:30.407711) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-01-13 13:07:30.408045) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-01-13 13:07:30.421384) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-01-13 13:07:30.421715) ========= rm -rf properties in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['rm', '-rf', 'properties'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=3a3620fb28aea1604ab609ef000001d2-1452719001.9378-1378824880 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004657 ========= master_lag: 0.04 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-01-13 13:07:30.470893) ========= ========= Started set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2016-01-13 13:07:30.471422) ========= script_repo_url: https://hg.mozilla.org/build/mozharness ========= Finished set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2016-01-13 13:07:30.471960) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-01-13 13:07:30.472295) ========= 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=3a3620fb28aea1604ab609ef000001d2-1452719001.9378-1378824880 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2016-01-13 13:07:30-- 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% 25.6M=0s 2016-01-13 13:07:30 (25.6 MB/s) - `archiver_client.py' saved [12141/12141] program finished with exit code 0 elapsedTime=0.168015 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-01-13 13:07:30.653209) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-01-13 13:07:30.653587) ========= rm -rf scripts in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['rm', '-rf', 'scripts'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=3a3620fb28aea1604ab609ef000001d2-1452719001.9378-1378824880 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.020929 ========= master_lag: 0.03 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-01-13 13:07:30.704569) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-01-13 13:07:30.704965) ========= bash -c 'python archiver_client.py mozharness --repo integration/fx-team --rev 3a531aa40e497499331f462fad9349201c9d7d98 --destination scripts --debug' in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', u'python archiver_client.py mozharness --repo integration/fx-team --rev 3a531aa40e497499331f462fad9349201c9d7d98 --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=3a3620fb28aea1604ab609ef000001d2-1452719001.9378-1378824880 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2016-01-13 13:07:30,911 truncating revision to first 12 chars 2016-01-13 13:07:30,911 Setting DEBUG logging. 2016-01-13 13:07:30,911 attempt 1/10 2016-01-13 13:07:30,912 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/integration/fx-team/3a531aa40e49?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2016-01-13 13:07:31,166 unpacking tar archive at: fx-team-3a531aa40e49/testing/mozharness/ program finished with exit code 0 elapsedTime=0.554742 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-01-13 13:07:31.273569) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-01-13 13:07:31.273938) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-01-13 13:07:31.284783) ========= ========= Started tinderboxprint_script_revlink (results: 0, elapsed: 0 secs) (at 2016-01-13 13:07:31.285090) ========= TinderboxPrint: script_revlink: https://hg.mozilla.org/build/mozharness/rev/production ========= Finished tinderboxprint_script_revlink (results: 0, elapsed: 0 secs) (at 2016-01-13 13:07:31.285567) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 21 mins, 28 secs) (at 2016-01-13 13:07:31.285913) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Fx-Team-Non-PGO --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Fx-Team-Non-PGO in dir /builds/slave/test/. (timeout 3600 secs) (maxTime 7200 secs) watching logfiles {} argv: ['/tools/buildbot/bin/python', 'scripts/scripts/talos_script.py', '--suite', 'dromaeojs-e10s', '--add-option', '--webServer,localhost', '--branch-name', 'Fx-Team-Non-PGO', '--cfg', 'talos/linux_config.py', '--download-symbols', 'ondemand', '--use-talos-json', '--blob-upload-branch', 'Fx-Team-Non-PGO'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PROPERTIES_FILE=/builds/slave/test/buildprops.json PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=3a3620fb28aea1604ab609ef000001d2-1452719001.9378-1378824880 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 13:07:31 INFO - MultiFileLogger online at 20160113 13:07:31 in /builds/slave/test 13:07:31 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Fx-Team-Non-PGO --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Fx-Team-Non-PGO 13:07:31 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 13:07:31 INFO - {'append_to_log': False, 13:07:31 INFO - 'base_work_dir': '/builds/slave/test', 13:07:31 INFO - 'blob_upload_branch': 'Fx-Team-Non-PGO', 13:07:31 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 13:07:31 INFO - 'branch': 'Fx-Team-Non-PGO', 13:07:31 INFO - 'buildbot_json_path': 'buildprops.json', 13:07:31 INFO - 'config_files': ('talos/linux_config.py',), 13:07:31 INFO - 'default_actions': ('clobber', 13:07:31 INFO - 'read-buildbot-config', 13:07:31 INFO - 'download-and-extract', 13:07:31 INFO - 'populate-webroot', 13:07:31 INFO - 'create-virtualenv', 13:07:31 INFO - 'install', 13:07:31 INFO - 'run-tests'), 13:07:31 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 13:07:31 INFO - 'download_minidump_stackwalk': True, 13:07:31 INFO - 'download_symbols': 'ondemand', 13:07:31 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 13:07:31 INFO - 'tooltool.py': '/tools/tooltool.py', 13:07:31 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 13:07:31 INFO - '/tools/misc-python/virtualenv.py')}, 13:07:31 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 13:07:31 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 13:07:31 INFO - 'installer_path': 'installer.exe', 13:07:31 INFO - 'log_level': 'info', 13:07:31 INFO - 'log_name': 'talos', 13:07:31 INFO - 'log_to_console': True, 13:07:31 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 13:07:31 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 13:07:31 INFO - 'opt_config_files': (), 13:07:31 INFO - 'pip_index': False, 13:07:31 INFO - 'sps_profile': False, 13:07:31 INFO - 'sps_profile_interval': 0, 13:07:31 INFO - 'suite': 'dromaeojs-e10s', 13:07:31 INFO - 'system_bits': '32', 13:07:31 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 13:07:31 INFO - 'title': 'talos-linux64-ix-059', 13:07:31 INFO - 'tooltool_cache': '/builds/tooltool_cache', 13:07:31 INFO - 'use_talos_json': True, 13:07:31 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 13:07:31 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 13:07:31 INFO - 'work_dir': 'build'} 13:07:31 INFO - ##### 13:07:31 INFO - ##### Running clobber step. 13:07:31 INFO - ##### 13:07:31 INFO - Running pre-action listener: _resource_record_pre_action 13:07:31 INFO - Running main action method: clobber 13:07:31 INFO - rmtree: /builds/slave/test/build 13:07:31 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 13:07:32 INFO - Running post-action listener: _resource_record_post_action 13:07:32 INFO - ##### 13:07:32 INFO - ##### Running read-buildbot-config step. 13:07:32 INFO - ##### 13:07:32 INFO - Running pre-action listener: _resource_record_pre_action 13:07:32 INFO - Running main action method: read_buildbot_config 13:07:32 INFO - Using buildbot properties: 13:07:32 INFO - { 13:07:32 INFO - "project": "", 13:07:32 INFO - "product": "firefox", 13:07:32 INFO - "script_repo_revision": "production", 13:07:32 INFO - "builddir": "fx-team_ubuntu64_hw_test-dromaeojs-e10s", 13:07:32 INFO - "repository": "", 13:07:32 INFO - "buildername": "Ubuntu HW 12.04 x64 fx-team talos dromaeojs-e10s", 13:07:32 INFO - "buildid": "20160113122832", 13:07:32 INFO - "pgo_build": "False", 13:07:32 INFO - "basedir": "/builds/slave/test", 13:07:32 INFO - "buildnumber": 684, 13:07:32 INFO - "slavename": "talos-linux64-ix-059", 13:07:32 INFO - "master": "http://buildbot-master105.bb.releng.scl3.mozilla.com:8201/", 13:07:32 INFO - "platform": "ubuntu64_hw", 13:07:32 INFO - "scheduler": "tests-fx-team-linux64-talos", 13:07:32 INFO - "branch": "fx-team", 13:07:32 INFO - "repo_path": "integration/fx-team", 13:07:32 INFO - "revision": "3a531aa40e497499331f462fad9349201c9d7d98", 13:07:32 INFO - "stage_platform": "linux64", 13:07:32 INFO - "builduid": "c1f7e108569e40fb83b46a6d996a6e9f", 13:07:32 INFO - "slavebuilddir": "test" 13:07:32 INFO - } 13:07:32 INFO - Found installer url https://queue.taskcluster.net/v1/task/Q-cw-MauRi-2bUM75RpNuA/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.tar.bz2. 13:07:32 INFO - Running post-action listener: _resource_record_post_action 13:07:32 INFO - ##### 13:07:32 INFO - ##### Running download-and-extract step. 13:07:32 INFO - ##### 13:07:32 INFO - Running pre-action listener: _resource_record_pre_action 13:07:32 INFO - Running main action method: download_and_extract 13:07:32 INFO - mkdir: /builds/slave/test/build/tests 13:07:32 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 13:07:32 INFO - https://queue.taskcluster.net/v1/task/Q-cw-MauRi-2bUM75RpNuA/artifacts/public/build/test_packages.json matches https://queue.taskcluster.net 13:07:32 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Q-cw-MauRi-2bUM75RpNuA/artifacts/public/build/test_packages.json 13:07:32 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Q-cw-MauRi-2bUM75RpNuA/artifacts/public/build/test_packages.json 13:07:32 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Q-cw-MauRi-2bUM75RpNuA/artifacts/public/build/test_packages.json to /builds/slave/test/build/test_packages.json 13:07:32 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Q-cw-MauRi-2bUM75RpNuA/artifacts/public/build/test_packages.json', 'file_name': '/builds/slave/test/build/test_packages.json'}, attempt #1 13:07:33 INFO - Downloaded 1448 bytes. 13:07:33 INFO - Reading from file /builds/slave/test/build/test_packages.json 13:07:33 INFO - Using the following test package requirements: 13:07:33 INFO - {u'common': [u'firefox-46.0a1.en-US.linux-x86_64.common.tests.zip'], 13:07:33 INFO - u'cppunittest': [u'firefox-46.0a1.en-US.linux-x86_64.common.tests.zip', 13:07:33 INFO - u'firefox-46.0a1.en-US.linux-x86_64.cppunittest.tests.zip'], 13:07:33 INFO - u'gtest': [u'firefox-46.0a1.en-US.linux-x86_64.common.tests.zip', 13:07:33 INFO - u'firefox-46.0a1.en-US.linux-x86_64.gtest.tests.zip'], 13:07:33 INFO - u'jittest': [u'firefox-46.0a1.en-US.linux-x86_64.common.tests.zip', 13:07:33 INFO - u'jsshell-linux-x86_64.zip'], 13:07:33 INFO - u'mochitest': [u'firefox-46.0a1.en-US.linux-x86_64.common.tests.zip', 13:07:33 INFO - u'firefox-46.0a1.en-US.linux-x86_64.mochitest.tests.zip'], 13:07:33 INFO - u'mozbase': [u'firefox-46.0a1.en-US.linux-x86_64.common.tests.zip'], 13:07:33 INFO - u'reftest': [u'firefox-46.0a1.en-US.linux-x86_64.common.tests.zip', 13:07:33 INFO - u'firefox-46.0a1.en-US.linux-x86_64.reftest.tests.zip'], 13:07:33 INFO - u'talos': [u'firefox-46.0a1.en-US.linux-x86_64.common.tests.zip', 13:07:33 INFO - u'firefox-46.0a1.en-US.linux-x86_64.talos.tests.zip'], 13:07:33 INFO - u'web-platform': [u'firefox-46.0a1.en-US.linux-x86_64.common.tests.zip', 13:07:33 INFO - u'firefox-46.0a1.en-US.linux-x86_64.web-platform.tests.zip'], 13:07:33 INFO - u'webapprt': [u'firefox-46.0a1.en-US.linux-x86_64.common.tests.zip'], 13:07:33 INFO - u'xpcshell': [u'firefox-46.0a1.en-US.linux-x86_64.common.tests.zip', 13:07:33 INFO - u'firefox-46.0a1.en-US.linux-x86_64.xpcshell.tests.zip']} 13:07:33 INFO - Downloading packages: [u'firefox-46.0a1.en-US.linux-x86_64.common.tests.zip'] for test suite category: common 13:07:33 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:07:33 INFO - https://queue.taskcluster.net/v1/task/Q-cw-MauRi-2bUM75RpNuA/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 13:07:33 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Q-cw-MauRi-2bUM75RpNuA/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip 13:07:33 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Q-cw-MauRi-2bUM75RpNuA/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip 13:07:33 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Q-cw-MauRi-2bUM75RpNuA/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip to /builds/slave/test/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip 13:07:33 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Q-cw-MauRi-2bUM75RpNuA/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip'}, attempt #1 13:07:36 INFO - Downloaded 22762613 bytes. 13:07:36 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip'] in /builds/slave/test/build/tests 13:07:36 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip 13:07:36 INFO - Calling ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip'] with output_timeout 1760 13:07:37 INFO - Return code: 0 13:07:37 INFO - Downloading packages: [u'firefox-46.0a1.en-US.linux-x86_64.common.tests.zip', u'firefox-46.0a1.en-US.linux-x86_64.talos.tests.zip'] for test suite category: talos 13:07:37 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 13:07:37 INFO - https://queue.taskcluster.net/v1/task/Q-cw-MauRi-2bUM75RpNuA/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 13:07:37 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Q-cw-MauRi-2bUM75RpNuA/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip 13:07:37 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Q-cw-MauRi-2bUM75RpNuA/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip 13:07:37 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Q-cw-MauRi-2bUM75RpNuA/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip to /builds/slave/test/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip 13:07:37 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Q-cw-MauRi-2bUM75RpNuA/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip'}, attempt #1 13:07:50 INFO - Downloaded 22762613 bytes. 13:07:50 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip'] in /builds/slave/test/build/tests 13:07:50 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip 13:07:50 INFO - Calling ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip'] with output_timeout 1760 13:07:51 INFO - Return code: 0 13:07:51 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:07:51 INFO - https://queue.taskcluster.net/v1/task/Q-cw-MauRi-2bUM75RpNuA/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.talos.tests.zip matches https://queue.taskcluster.net 13:07:51 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Q-cw-MauRi-2bUM75RpNuA/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.talos.tests.zip 13:07:51 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Q-cw-MauRi-2bUM75RpNuA/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.talos.tests.zip 13:07:51 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Q-cw-MauRi-2bUM75RpNuA/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.talos.tests.zip to /builds/slave/test/build/firefox-46.0a1.en-US.linux-x86_64.talos.tests.zip 13:07:51 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Q-cw-MauRi-2bUM75RpNuA/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.talos.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-46.0a1.en-US.linux-x86_64.talos.tests.zip'}, attempt #1 13:07:53 INFO - Downloaded 11132144 bytes. 13:07:53 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-46.0a1.en-US.linux-x86_64.talos.tests.zip'] in /builds/slave/test/build/tests 13:07:53 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-46.0a1.en-US.linux-x86_64.talos.tests.zip 13:07:53 INFO - Calling ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-46.0a1.en-US.linux-x86_64.talos.tests.zip'] with output_timeout 1760 13:07:54 INFO - Return code: 0 13:07:54 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 13:07:54 INFO - https://queue.taskcluster.net/v1/task/Q-cw-MauRi-2bUM75RpNuA/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.tar.bz2 matches https://queue.taskcluster.net 13:07:54 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Q-cw-MauRi-2bUM75RpNuA/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.tar.bz2 13:07:54 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Q-cw-MauRi-2bUM75RpNuA/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.tar.bz2 13:07:54 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Q-cw-MauRi-2bUM75RpNuA/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.tar.bz2 to /builds/slave/test/build/firefox-46.0a1.en-US.linux-x86_64.tar.bz2 13:07:54 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/Q-cw-MauRi-2bUM75RpNuA/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.tar.bz2', 'file_name': '/builds/slave/test/build/firefox-46.0a1.en-US.linux-x86_64.tar.bz2'}, attempt #1 13:07:58 INFO - Downloaded 54051937 bytes. 13:07:58 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/Q-cw-MauRi-2bUM75RpNuA/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.tar.bz2 13:07:58 INFO - mkdir: /builds/slave/test/properties 13:07:58 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 13:07:58 INFO - Writing to file /builds/slave/test/properties/build_url 13:07:58 INFO - Contents: 13:07:58 INFO - build_url:https://queue.taskcluster.net/v1/task/Q-cw-MauRi-2bUM75RpNuA/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.tar.bz2 13:07:58 INFO - Running post-action listener: _resource_record_post_action 13:07:58 INFO - Running post-action listener: set_extra_try_arguments 13:07:58 INFO - ##### 13:07:58 INFO - ##### Running populate-webroot step. 13:07:58 INFO - ##### 13:07:58 INFO - Running pre-action listener: _resource_record_pre_action 13:07:58 INFO - Running main action method: populate_webroot 13:07:58 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 13:07:58 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 13:07:58 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 13:07:58 INFO - '--tppagecycles', 13:07:58 INFO - '7'], 13:07:58 INFO - 'tests': ['tsvgm']}}, 13:07:58 INFO - 'suites': {'chromez': {'tests': ['tresize', 'tcanvasmark']}, 13:07:58 INFO - 'chromez-e10s': {'talos_options': ['--e10s'], 13:07:58 INFO - 'tests': ['tresize', 'tcanvasmark']}, 13:07:58 INFO - 'dromaeojs': {'tests': ['dromaeo_css', 'kraken', 'v8_7']}, 13:07:58 INFO - 'dromaeojs-e10s': {'talos_options': ['--e10s'], 13:07:58 INFO - 'tests': ['dromaeo_css', 'kraken', 'v8_7']}, 13:07:58 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 13:07:58 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 13:07:58 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 13:07:58 INFO - 'talos_options': ['--e10s'], 13:07:58 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 13:07:58 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 13:07:58 INFO - 'tests': ['damp', 'tps']}, 13:07:58 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 13:07:58 INFO - 'talos_options': ['--e10s'], 13:07:58 INFO - 'tests': ['damp', 'tps']}, 13:07:58 INFO - 'g3': {'tests': ['dromaeo_dom']}, 13:07:58 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 13:07:58 INFO - 'other': {'tests': ['a11yr', 13:07:58 INFO - 'ts_paint', 13:07:58 INFO - 'tpaint', 13:07:58 INFO - 'sessionrestore', 13:07:58 INFO - 'sessionrestore_no_auto_restore']}, 13:07:58 INFO - 'other-e10s': {'talos_options': ['--e10s'], 13:07:58 INFO - 'tests': ['a11yr', 13:07:58 INFO - 'ts_paint', 13:07:58 INFO - 'tpaint', 13:07:58 INFO - 'sessionrestore', 13:07:58 INFO - 'sessionrestore_no_auto_restore']}, 13:07:58 INFO - 'other-e10s_l64': {'talos_options': ['--e10s'], 13:07:58 INFO - 'tests': ['a11yr', 13:07:58 INFO - 'ts_paint', 13:07:58 INFO - 'tpaint', 13:07:58 INFO - 'sessionrestore', 13:07:58 INFO - 'sessionrestore_no_auto_restore']}, 13:07:58 INFO - 'other-e10s_nol64': {'talos_options': ['--e10s'], 13:07:58 INFO - 'tests': ['a11yr', 13:07:58 INFO - 'ts_paint', 13:07:58 INFO - 'tpaint', 13:07:58 INFO - 'sessionrestore', 13:07:58 INFO - 'sessionrestore_no_auto_restore']}, 13:07:58 INFO - 'other_l64': {'tests': ['a11yr', 13:07:58 INFO - 'ts_paint', 13:07:58 INFO - 'tpaint', 13:07:58 INFO - 'sessionrestore', 13:07:58 INFO - 'sessionrestore_no_auto_restore']}, 13:07:58 INFO - 'other_nol64': {'tests': ['a11yr', 13:07:58 INFO - 'ts_paint', 13:07:58 INFO - 'tpaint', 13:07:58 INFO - 'sessionrestore', 13:07:58 INFO - 'sessionrestore_no_auto_restore']}, 13:07:58 INFO - 'svgr': {'tests': ['tsvgx', 13:07:58 INFO - 'tsvgr_opacity', 13:07:58 INFO - 'tart', 13:07:58 INFO - 'tscrollx', 13:07:58 INFO - 'cart']}, 13:07:58 INFO - 'svgr-e10s': {'talos_options': ['--e10s'], 13:07:58 INFO - 'tests': ['tsvgx', 13:07:58 INFO - 'tsvgr_opacity', 13:07:58 INFO - 'tart', 13:07:58 INFO - 'tscrollx', 13:07:58 INFO - 'cart']}, 13:07:58 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 13:07:58 INFO - 'tests': ['tp5o']}, 13:07:58 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 13:07:58 INFO - 'talos_options': ['--e10s'], 13:07:58 INFO - 'tests': ['tp5o']}, 13:07:58 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 13:07:58 INFO - 'talos_options': ['--xperf_path', 13:07:58 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 13:07:58 INFO - 'tests': ['tp5n']}, 13:07:58 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 13:07:58 INFO - 'talos_options': ['--e10s', 13:07:58 INFO - '--xperf_path', 13:07:58 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 13:07:58 INFO - 'tests': ['tp5n']}}, 13:07:58 INFO - 'talos.zip': {'path': '', 13:07:58 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 13:07:58 INFO - Running post-action listener: _resource_record_post_action 13:07:58 INFO - ##### 13:07:58 INFO - ##### Running create-virtualenv step. 13:07:58 INFO - ##### 13:07:58 INFO - Running pre-action listener: _resource_record_pre_action 13:07:58 INFO - Running main action method: create_virtualenv 13:07:58 INFO - Creating virtualenv /builds/slave/test/build/venv 13:07:58 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:07:58 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 13:07:58 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 13:07:58 INFO - Using real prefix '/usr' 13:07:58 INFO - New python executable in /builds/slave/test/build/venv/bin/python 13:07:58 INFO - Installing distribute.............................................................................................................................................................................................done. 13:08:00 INFO - Installing pip.................done. 13:08:00 INFO - Return code: 0 13:08:00 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 13:08:00 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:08:00 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 13:08:00 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 13:08:00 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:08:00 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 13:08:00 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 13:08:00 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'pip>=1.5']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fa798cf7f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x15e08a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x16afdd0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x17423d0>, '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 0x16aded0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x16ae360>, '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': '3a3620fb28aea1604ab609ef000001d2-1452719001.9378-1378824880', '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:08:00 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'pip>=1.5'] in /builds/slave/test/build 13:08:00 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --download-cache /builds/slave/test/build/venv/cache --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub pip>=1.5 13:08:00 INFO - Using env: {'DISPLAY': ':0', 13:08:00 INFO - 'HOME': '/home/cltbld', 13:08:00 INFO - 'LANG': 'en_US.UTF-8', 13:08:00 INFO - 'LANGUAGE': 'en_US:en', 13:08:00 INFO - 'LOGNAME': 'cltbld', 13:08:00 INFO - 'MAIL': '/var/mail/cltbld', 13:08:00 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 13:08:00 INFO - 'MOZ_NO_REMOTE': '1', 13:08:00 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 13:08:00 INFO - 'NO_EM_RESTART': '1', 13:08:00 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 13:08:00 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 13:08:00 INFO - 'PWD': '/builds/slave/test', 13:08:00 INFO - 'SHELL': '/bin/bash', 13:08:00 INFO - 'SHLVL': '1', 13:08:00 INFO - 'TERM': 'linux', 13:08:00 INFO - 'TMOUT': '86400', 13:08:00 INFO - 'USER': 'cltbld', 13:08:00 INFO - 'XDG_SESSION_COOKIE': '3a3620fb28aea1604ab609ef000001d2-1452719001.9378-1378824880', 13:08:00 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 13:08:00 INFO - '_': '/tools/buildbot/bin/python'} 13:08:00 INFO - Ignoring indexes: https://pypi.python.org/simple/ 13:08:00 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:08:00 INFO - Cleaning up... 13:08:00 INFO - Return code: 0 13:08:00 INFO - Installing psutil>=0.7.1 into virtualenv /builds/slave/test/build/venv 13:08:00 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:08:00 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 13:08:00 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 13:08:00 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:08:00 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 13:08:00 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 13:08:00 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'psutil>=0.7.1']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fa798cf7f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x15e08a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x16afdd0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x17423d0>, '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 0x16aded0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x16ae360>, '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': '3a3620fb28aea1604ab609ef000001d2-1452719001.9378-1378824880', '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:08:00 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'psutil>=0.7.1'] in /builds/slave/test/build 13:08:00 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --download-cache /builds/slave/test/build/venv/cache --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub psutil>=0.7.1 13:08:00 INFO - Using env: {'DISPLAY': ':0', 13:08:00 INFO - 'HOME': '/home/cltbld', 13:08:00 INFO - 'LANG': 'en_US.UTF-8', 13:08:00 INFO - 'LANGUAGE': 'en_US:en', 13:08:00 INFO - 'LOGNAME': 'cltbld', 13:08:00 INFO - 'MAIL': '/var/mail/cltbld', 13:08:00 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 13:08:00 INFO - 'MOZ_NO_REMOTE': '1', 13:08:00 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 13:08:00 INFO - 'NO_EM_RESTART': '1', 13:08:00 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 13:08:00 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 13:08:00 INFO - 'PWD': '/builds/slave/test', 13:08:00 INFO - 'SHELL': '/bin/bash', 13:08:00 INFO - 'SHLVL': '1', 13:08:00 INFO - 'TERM': 'linux', 13:08:00 INFO - 'TMOUT': '86400', 13:08:00 INFO - 'USER': 'cltbld', 13:08:00 INFO - 'XDG_SESSION_COOKIE': '3a3620fb28aea1604ab609ef000001d2-1452719001.9378-1378824880', 13:08:00 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 13:08:00 INFO - '_': '/tools/buildbot/bin/python'} 13:08:01 INFO - Ignoring indexes: https://pypi.python.org/simple/ 13:08:01 INFO - Downloading/unpacking psutil>=0.7.1 13:08:01 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 13:08:01 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 13:08:01 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 13:08:01 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 13:08:01 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 13:08:01 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 13:08:02 INFO - Creating supposed download cache at /builds/slave/test/build/venv/cache 13:08:02 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fpsutil-3.1.1.tar.gz 13:08:02 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 13:08:02 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 13:08:02 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 13:08:02 INFO - Installing collected packages: psutil 13:08:02 INFO - Running setup.py install for psutil 13:08:03 INFO - building 'psutil._psutil_linux' extension 13:08:03 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:08:03 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:08:03 INFO - building 'psutil._psutil_posix' extension 13:08:03 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:08:03 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:08:03 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 13:08:03 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 13:08:03 INFO - Successfully installed psutil 13:08:03 INFO - Cleaning up... 13:08:03 INFO - Return code: 0 13:08:03 INFO - Installing mozsystemmonitor==0.0.0 into virtualenv /builds/slave/test/build/venv 13:08:03 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 13:08:03 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 13:08:03 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 13:08:03 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 13:08:03 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 13:08:03 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 13:08:03 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'mozsystemmonitor==0.0.0']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fa798cf7f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x15e08a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x16afdd0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x17423d0>, '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 0x16aded0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x16ae360>, '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': '3a3620fb28aea1604ab609ef000001d2-1452719001.9378-1378824880', '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:08:03 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'mozsystemmonitor==0.0.0'] in /builds/slave/test/build 13:08:03 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --download-cache /builds/slave/test/build/venv/cache --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub mozsystemmonitor==0.0.0 13:08:03 INFO - Using env: {'DISPLAY': ':0', 13:08:03 INFO - 'HOME': '/home/cltbld', 13:08:03 INFO - 'LANG': 'en_US.UTF-8', 13:08:03 INFO - 'LANGUAGE': 'en_US:en', 13:08:03 INFO - 'LOGNAME': 'cltbld', 13:08:03 INFO - 'MAIL': '/var/mail/cltbld', 13:08:03 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 13:08:03 INFO - 'MOZ_NO_REMOTE': '1', 13:08:03 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 13:08:03 INFO - 'NO_EM_RESTART': '1', 13:08:03 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 13:08:03 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 13:08:03 INFO - 'PWD': '/builds/slave/test', 13:08:03 INFO - 'SHELL': '/bin/bash', 13:08:03 INFO - 'SHLVL': '1', 13:08:03 INFO - 'TERM': 'linux', 13:08:03 INFO - 'TMOUT': '86400', 13:08:03 INFO - 'USER': 'cltbld', 13:08:03 INFO - 'XDG_SESSION_COOKIE': '3a3620fb28aea1604ab609ef000001d2-1452719001.9378-1378824880', 13:08:03 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 13:08:03 INFO - '_': '/tools/buildbot/bin/python'} 13:08:03 INFO - Ignoring indexes: https://pypi.python.org/simple/ 13:08:03 INFO - Downloading/unpacking mozsystemmonitor==0.0.0 13:08:03 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 13:08:03 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 13:08:03 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 13:08:03 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 13:08:03 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 13:08:03 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 13:08:05 INFO - Downloading mozsystemmonitor-0.0.tar.gz 13:08:05 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fmozsystemmonitor-0.0.tar.gz 13:08:05 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 13:08:05 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:08:05 INFO - Installing collected packages: mozsystemmonitor 13:08:05 INFO - Running setup.py install for mozsystemmonitor 13:08:05 INFO - Successfully installed mozsystemmonitor 13:08:05 INFO - Cleaning up... 13:08:05 INFO - Return code: 0 13:08:05 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 13:08:05 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:08:05 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 13:08:05 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 13:08:05 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:08:05 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 13:08:05 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 13:08:05 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'blobuploader==1.2.4']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fa798cf7f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x15e08a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x16afdd0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x17423d0>, '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 0x16aded0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x16ae360>, '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': '3a3620fb28aea1604ab609ef000001d2-1452719001.9378-1378824880', '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:08:05 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'blobuploader==1.2.4'] in /builds/slave/test/build 13:08:05 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --download-cache /builds/slave/test/build/venv/cache --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub blobuploader==1.2.4 13:08:05 INFO - Using env: {'DISPLAY': ':0', 13:08:05 INFO - 'HOME': '/home/cltbld', 13:08:05 INFO - 'LANG': 'en_US.UTF-8', 13:08:05 INFO - 'LANGUAGE': 'en_US:en', 13:08:05 INFO - 'LOGNAME': 'cltbld', 13:08:05 INFO - 'MAIL': '/var/mail/cltbld', 13:08:05 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 13:08:05 INFO - 'MOZ_NO_REMOTE': '1', 13:08:05 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 13:08:05 INFO - 'NO_EM_RESTART': '1', 13:08:05 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 13:08:05 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 13:08:05 INFO - 'PWD': '/builds/slave/test', 13:08:05 INFO - 'SHELL': '/bin/bash', 13:08:05 INFO - 'SHLVL': '1', 13:08:05 INFO - 'TERM': 'linux', 13:08:05 INFO - 'TMOUT': '86400', 13:08:05 INFO - 'USER': 'cltbld', 13:08:05 INFO - 'XDG_SESSION_COOKIE': '3a3620fb28aea1604ab609ef000001d2-1452719001.9378-1378824880', 13:08:05 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 13:08:05 INFO - '_': '/tools/buildbot/bin/python'} 13:08:05 INFO - Ignoring indexes: https://pypi.python.org/simple/ 13:08:05 INFO - Downloading/unpacking blobuploader==1.2.4 13:08:05 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:08:05 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:08:05 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:08:05 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:08:05 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:08:05 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:08:07 INFO - Downloading blobuploader-1.2.4.tar.gz 13:08:07 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fblobuploader-1.2.4.tar.gz 13:08:07 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 13:08:07 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 13:08:07 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 13:08:07 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 13:08:07 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 13:08:07 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 13:08:07 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 13:08:07 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 13:08:07 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Frequests-1.2.3.tar.gz 13:08:07 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 13:08:07 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 13:08:07 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 13:08:07 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 13:08:07 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 13:08:07 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 13:08:07 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 13:08:07 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 13:08:08 INFO - Downloading docopt-0.6.1.tar.gz 13:08:08 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fdocopt-0.6.1.tar.gz 13:08:08 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 13:08:08 INFO - Installing collected packages: blobuploader, requests, docopt 13:08:08 INFO - Running setup.py install for blobuploader 13:08:08 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 13:08:08 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 13:08:08 INFO - Running setup.py install for requests 13:08:08 INFO - Running setup.py install for docopt 13:08:08 INFO - Successfully installed blobuploader requests docopt 13:08:08 INFO - Cleaning up... 13:08:08 INFO - Return code: 0 13:08:08 INFO - Installing None into virtualenv /builds/slave/test/build/venv 13:08: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:08:08 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 13:08:08 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 13:08: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:08:08 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 13:08:08 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 13:08:08 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--no-deps', '--download-cache', '/builds/slave/test/build/venv/cache', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fa798cf7f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x15e08a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x16afdd0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x17423d0>, '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 0x16aded0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x16ae360>, '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': '3a3620fb28aea1604ab609ef000001d2-1452719001.9378-1378824880', '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:08:08 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--no-deps', '--download-cache', '/builds/slave/test/build/venv/cache', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test/build/tests/config 13:08:08 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --no-deps --download-cache /builds/slave/test/build/venv/cache --timeout 120 -r /builds/slave/test/build/tests/config/mozbase_requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 13:08:08 INFO - Using env: {'DISPLAY': ':0', 13:08:08 INFO - 'HOME': '/home/cltbld', 13:08:08 INFO - 'LANG': 'en_US.UTF-8', 13:08:08 INFO - 'LANGUAGE': 'en_US:en', 13:08:08 INFO - 'LOGNAME': 'cltbld', 13:08:08 INFO - 'MAIL': '/var/mail/cltbld', 13:08:08 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 13:08:08 INFO - 'MOZ_NO_REMOTE': '1', 13:08:08 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 13:08:08 INFO - 'NO_EM_RESTART': '1', 13:08:08 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 13:08:08 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 13:08:08 INFO - 'PWD': '/builds/slave/test', 13:08:08 INFO - 'SHELL': '/bin/bash', 13:08:08 INFO - 'SHLVL': '1', 13:08:08 INFO - 'TERM': 'linux', 13:08:08 INFO - 'TMOUT': '86400', 13:08:08 INFO - 'USER': 'cltbld', 13:08:08 INFO - 'XDG_SESSION_COOKIE': '3a3620fb28aea1604ab609ef000001d2-1452719001.9378-1378824880', 13:08:08 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 13:08:08 INFO - '_': '/tools/buildbot/bin/python'} 13:08:09 INFO - Ignoring indexes: https://pypi.python.org/simple/ 13:08:09 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 13:08:09 INFO - Running setup.py (path:/tmp/pip-H7ObkV-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 13:08:09 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 13:08:09 INFO - Running setup.py (path:/tmp/pip-OxD8cX-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 13:08:09 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 13:08:09 INFO - Running setup.py (path:/tmp/pip-M6WK6M-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 13:08:09 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 13:08:09 INFO - Running setup.py (path:/tmp/pip-3NidoJ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 13:08:09 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 13:08:09 INFO - Running setup.py (path:/tmp/pip-_xaMo3-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 13:08:09 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 13:08:09 INFO - Running setup.py (path:/tmp/pip-xCF7L9-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 13:08:09 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 13:08:09 INFO - Running setup.py (path:/tmp/pip-ULF9kk-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 13:08:09 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 13:08:09 INFO - Running setup.py (path:/tmp/pip-zrvCEH-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 13:08:09 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 13:08:09 INFO - Running setup.py (path:/tmp/pip-grPsFF-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 13:08:09 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 13:08:09 INFO - Running setup.py (path:/tmp/pip-l4xObe-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 13:08:09 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 13:08:09 INFO - Running setup.py (path:/tmp/pip-htRgbD-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 13:08:09 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 13:08:09 INFO - Running setup.py (path:/tmp/pip-gAi6rV-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 13:08:09 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 13:08:09 INFO - Running setup.py (path:/tmp/pip-Zwol50-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 13:08:10 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 13:08:10 INFO - Running setup.py (path:/tmp/pip-jiIvTe-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 13:08:10 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 13:08:10 INFO - Running setup.py (path:/tmp/pip-lt4iaX-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 13:08:10 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 13:08:10 INFO - Running setup.py (path:/tmp/pip-pw6RWa-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 13:08:10 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 13:08:10 INFO - Running setup.py (path:/tmp/pip-Z33XBW-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 13:08:10 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 13:08:10 INFO - Running setup.py install for manifestparser 13:08:10 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 13:08:10 INFO - Running setup.py install for mozcrash 13:08:10 INFO - Running setup.py install for mozdebug 13:08:10 INFO - Running setup.py install for mozdevice 13:08:10 INFO - Installing sutini script to /builds/slave/test/build/venv/bin 13:08:10 INFO - Installing dm script to /builds/slave/test/build/venv/bin 13:08:10 INFO - Running setup.py install for mozfile 13:08:10 INFO - Running setup.py install for mozhttpd 13:08:10 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 13:08:10 INFO - Running setup.py install for mozinfo 13:08:11 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 13:08:11 INFO - Running setup.py install for mozInstall 13:08:11 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 13:08:11 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 13:08:11 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 13:08:11 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 13:08:11 INFO - Running setup.py install for mozleak 13:08:11 INFO - Running setup.py install for mozlog 13:08:11 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 13:08:11 INFO - Running setup.py install for moznetwork 13:08:11 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 13:08:11 INFO - Running setup.py install for mozprocess 13:08:11 INFO - Running setup.py install for mozprofile 13:08:11 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 13:08:11 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 13:08:11 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 13:08:11 INFO - Running setup.py install for mozrunner 13:08:11 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 13:08:11 INFO - Running setup.py install for mozscreenshot 13:08:11 INFO - Running setup.py install for moztest 13:08:11 INFO - Running setup.py install for mozversion 13:08:12 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 13:08:12 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 13:08:12 INFO - Cleaning up... 13:08:12 INFO - Return code: 0 13:08:12 INFO - Installing None into virtualenv /builds/slave/test/build/venv 13:08: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:08:12 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 13:08:12 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 13:08: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:08:12 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 13:08:12 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 13:08:12 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--timeout', '120', '-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 0x7fa798cf7f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x15e08a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x16afdd0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x17423d0>, '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 0x16aded0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x16ae360>, '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': '3a3620fb28aea1604ab609ef000001d2-1452719001.9378-1378824880', '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:08:12 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test/build/tests/config 13:08:12 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --download-cache /builds/slave/test/build/venv/cache --timeout 120 -r /builds/slave/test/build/tests/config/mozbase_requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 13:08:12 INFO - Using env: {'DISPLAY': ':0', 13:08:12 INFO - 'HOME': '/home/cltbld', 13:08:12 INFO - 'LANG': 'en_US.UTF-8', 13:08:12 INFO - 'LANGUAGE': 'en_US:en', 13:08:12 INFO - 'LOGNAME': 'cltbld', 13:08:12 INFO - 'MAIL': '/var/mail/cltbld', 13:08:12 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 13:08:12 INFO - 'MOZ_NO_REMOTE': '1', 13:08:12 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 13:08:12 INFO - 'NO_EM_RESTART': '1', 13:08:12 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 13:08:12 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 13:08:12 INFO - 'PWD': '/builds/slave/test', 13:08:12 INFO - 'SHELL': '/bin/bash', 13:08:12 INFO - 'SHLVL': '1', 13:08:12 INFO - 'TERM': 'linux', 13:08:12 INFO - 'TMOUT': '86400', 13:08:12 INFO - 'USER': 'cltbld', 13:08:12 INFO - 'XDG_SESSION_COOKIE': '3a3620fb28aea1604ab609ef000001d2-1452719001.9378-1378824880', 13:08:12 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 13:08:12 INFO - '_': '/tools/buildbot/bin/python'} 13:08:12 INFO - Ignoring indexes: https://pypi.python.org/simple/ 13:08:12 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 13:08:12 INFO - Running setup.py (path:/tmp/pip-kY03y3-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 13:08:12 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:08:12 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 13:08:12 INFO - Running setup.py (path:/tmp/pip-ottRQI-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 13:08:12 INFO - Requirement already satisfied (use --upgrade to upgrade): mozcrash==0.16 from file:///builds/slave/test/build/tests/mozbase/mozcrash in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 13:08:12 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 13:08:12 INFO - Running setup.py (path:/tmp/pip-ZH65bT-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 13:08:12 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:08:12 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 13:08:12 INFO - Running setup.py (path:/tmp/pip-D_3U20-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 13:08:12 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:08:12 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 13:08:12 INFO - Running setup.py (path:/tmp/pip-YYGbuj-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 13:08:12 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:08:12 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 13:08:12 INFO - Running setup.py (path:/tmp/pip-soE7Bh-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 13:08:12 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:08:12 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 13:08:12 INFO - Running setup.py (path:/tmp/pip-W7f7pr-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 13:08:12 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:08:12 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 13:08:12 INFO - Running setup.py (path:/tmp/pip-gvbJlU-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 13:08:12 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:08:12 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 13:08:12 INFO - Running setup.py (path:/tmp/pip-FW5lFi-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 13:08:12 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:08:12 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 13:08:12 INFO - Running setup.py (path:/tmp/pip-1vOwg5-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 13:08:13 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:08:13 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 13:08:13 INFO - Running setup.py (path:/tmp/pip-tskT8I-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 13:08:13 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:08:13 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 13:08:13 INFO - Running setup.py (path:/tmp/pip-PT3aXe-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 13:08:13 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:08:13 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 13:08:13 INFO - Running setup.py (path:/tmp/pip-E6P_B5-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 13:08:13 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:08:13 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 13:08:13 INFO - Running setup.py (path:/tmp/pip-P2A214-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 13:08:13 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:08:13 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 13:08:13 INFO - Running setup.py (path:/tmp/pip-4q18p9-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 13:08:13 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:08:13 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 13:08:13 INFO - Running setup.py (path:/tmp/pip-Dl0Lqo-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 13:08:13 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:08:13 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 13:08:13 INFO - Running setup.py (path:/tmp/pip-btQkkt-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 13:08:13 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:08:13 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile>=1.0 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozcrash==0.16->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 13:08:13 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog>=3.0 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozcrash==0.16->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 13:08:13 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:08:13 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:08:13 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:08:13 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.1->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 13:08: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:08: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:08: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:08: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:08: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:08: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:08:15 INFO - Downloading blessings-1.5.1.tar.gz 13:08:15 INFO - Storing download in cache at /builds/slave/test/build/venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fblessings-1.5.1.tar.gz 13:08:15 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 13:08:15 INFO - Installing collected packages: blessings 13:08:15 INFO - Running setup.py install for blessings 13:08:15 INFO - Successfully installed blessings 13:08:15 INFO - Cleaning up... 13:08:15 INFO - Return code: 0 13:08:15 INFO - Done creating virtualenv /builds/slave/test/build/venv. 13:08:15 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 13:08:15 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 13:08:15 INFO - Reading from file tmpfile_stdout 13:08:15 INFO - Current package versions: 13:08:15 INFO - argparse == 1.2.1 13:08:15 INFO - blessings == 1.5.1 13:08:15 INFO - blobuploader == 1.2.4 13:08:15 INFO - docopt == 0.6.1 13:08:15 INFO - manifestparser == 1.1 13:08:15 INFO - mozInstall == 1.12 13:08:15 INFO - mozcrash == 0.16 13:08:15 INFO - mozdebug == 0.1 13:08:15 INFO - mozdevice == 0.48 13:08:15 INFO - mozfile == 1.2 13:08:15 INFO - mozhttpd == 0.7 13:08:15 INFO - mozinfo == 0.9 13:08:15 INFO - mozleak == 0.1 13:08:15 INFO - mozlog == 3.1 13:08:15 INFO - moznetwork == 0.27 13:08:15 INFO - mozprocess == 0.22 13:08:15 INFO - mozprofile == 0.28 13:08:15 INFO - mozrunner == 6.11 13:08:15 INFO - mozscreenshot == 0.1 13:08:15 INFO - mozsystemmonitor == 0.0 13:08:15 INFO - moztest == 0.7 13:08:15 INFO - mozversion == 1.4 13:08:15 INFO - psutil == 3.1.1 13:08:15 INFO - requests == 1.2.3 13:08:15 INFO - wsgiref == 0.1.2 13:08:15 INFO - Installing None into virtualenv /builds/slave/test/build/venv 13:08: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:08:15 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 13:08:15 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 13:08: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:08:15 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 13:08:15 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 13:08:15 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--timeout', '120', '-r', '/builds/slave/test/build/tests/talos/requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fa798cf7f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x15e08a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x16afdd0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x17423d0>, '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 0x16aded0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x16ae360>, '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': '3a3620fb28aea1604ab609ef000001d2-1452719001.9378-1378824880', '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:08:15 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--timeout', '120', '-r', '/builds/slave/test/build/tests/talos/requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test/build/tests/talos 13:08:15 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --download-cache /builds/slave/test/build/venv/cache --timeout 120 -r /builds/slave/test/build/tests/talos/requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 13:08:15 INFO - Using env: {'DISPLAY': ':0', 13:08:15 INFO - 'HOME': '/home/cltbld', 13:08:15 INFO - 'LANG': 'en_US.UTF-8', 13:08:15 INFO - 'LANGUAGE': 'en_US:en', 13:08:15 INFO - 'LOGNAME': 'cltbld', 13:08:15 INFO - 'MAIL': '/var/mail/cltbld', 13:08:15 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 13:08:15 INFO - 'MOZ_NO_REMOTE': '1', 13:08:15 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 13:08:15 INFO - 'NO_EM_RESTART': '1', 13:08:15 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 13:08:15 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 13:08:15 INFO - 'PWD': '/builds/slave/test', 13:08:15 INFO - 'SHELL': '/bin/bash', 13:08:15 INFO - 'SHLVL': '1', 13:08:15 INFO - 'TERM': 'linux', 13:08:15 INFO - 'TMOUT': '86400', 13:08:15 INFO - 'USER': 'cltbld', 13:08:15 INFO - 'XDG_SESSION_COOKIE': '3a3620fb28aea1604ab609ef000001d2-1452719001.9378-1378824880', 13:08:15 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 13:08:15 INFO - '_': '/tools/buildbot/bin/python'} 13:08:15 INFO - Ignoring indexes: https://pypi.python.org/simple/ 13:08:15 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:08:15 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:08:15 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:08:15 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:08:15 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:08:15 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:08:15 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:08:15 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:08:15 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:08:15 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:08:15 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:08:15 INFO - Cleaning up... 13:08:15 INFO - Return code: 0 13:08:15 INFO - Installing jsonschema into virtualenv /builds/slave/test/build/venv 13:08: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:08:15 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 13:08:15 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 13:08: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:08:15 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 13:08:15 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 13:08:15 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fa798cf7f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x15e08a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x16afdd0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x17423d0>, '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 0x16aded0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x16ae360>, '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': '3a3620fb28aea1604ab609ef000001d2-1452719001.9378-1378824880', '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:08:15 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema'] in /builds/slave/test/build 13:08:15 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --download-cache /builds/slave/test/build/venv/cache --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub jsonschema 13:08:15 INFO - Using env: {'DISPLAY': ':0', 13:08:15 INFO - 'HOME': '/home/cltbld', 13:08:15 INFO - 'LANG': 'en_US.UTF-8', 13:08:15 INFO - 'LANGUAGE': 'en_US:en', 13:08:15 INFO - 'LOGNAME': 'cltbld', 13:08:15 INFO - 'MAIL': '/var/mail/cltbld', 13:08:15 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 13:08:15 INFO - 'MOZ_NO_REMOTE': '1', 13:08:15 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 13:08:15 INFO - 'NO_EM_RESTART': '1', 13:08:15 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 13:08:15 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 13:08:15 INFO - 'PWD': '/builds/slave/test', 13:08:15 INFO - 'SHELL': '/bin/bash', 13:08:15 INFO - 'SHLVL': '1', 13:08:15 INFO - 'TERM': 'linux', 13:08:15 INFO - 'TMOUT': '86400', 13:08:15 INFO - 'USER': 'cltbld', 13:08:15 INFO - 'XDG_SESSION_COOKIE': '3a3620fb28aea1604ab609ef000001d2-1452719001.9378-1378824880', 13:08:15 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 13:08:15 INFO - '_': '/tools/buildbot/bin/python'} 13:08:16 INFO - Ignoring indexes: https://pypi.python.org/simple/ 13:08:16 INFO - Downloading/unpacking jsonschema 13:08:16 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:08:16 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:08:16 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:08:16 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:08:16 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:08:16 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:08:17 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 13:08:17 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fjsonschema-2.5.1-py2.py3-none-any.whl 13:08:17 INFO - Downloading/unpacking functools32 (from jsonschema) 13:08:17 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:08:17 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:08:17 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:08:17 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:08:17 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:08:17 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:08:18 INFO - Downloading functools32-3.2.3-2.tar.gz 13:08:18 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Ffunctools32-3.2.3-2.tar.gz 13:08:18 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/functools32/setup.py) egg_info for package functools32 13:08:18 INFO - warning: no files found matching '*.txt' 13:08:18 INFO - no previously-included directories found matching 'build' 13:08:18 INFO - no previously-included directories found matching 'dist' 13:08:18 INFO - no previously-included directories found matching '.git*' 13:08:18 INFO - Installing collected packages: jsonschema, functools32 13:08:18 INFO - Running setup.py install for functools32 13:08:18 INFO - warning: no files found matching '*.txt' 13:08:18 INFO - no previously-included directories found matching 'build' 13:08:18 INFO - no previously-included directories found matching 'dist' 13:08:18 INFO - no previously-included directories found matching '.git*' 13:08:18 INFO - Successfully installed jsonschema functools32 13:08:18 INFO - Cleaning up... 13:08:18 INFO - Return code: 0 13:08:18 INFO - Installing flake8 into virtualenv /builds/slave/test/build/venv 13:08: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:08:18 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 13:08:18 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 13:08: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:08:18 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 13:08:18 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 13:08:18 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'flake8']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7fa798cf7f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x15e08a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x16afdd0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x17423d0>, '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 0x16aded0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x16ae360>, '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': '3a3620fb28aea1604ab609ef000001d2-1452719001.9378-1378824880', '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:08:18 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--download-cache', '/builds/slave/test/build/venv/cache', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'flake8'] in /builds/slave/test/build 13:08:18 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --download-cache /builds/slave/test/build/venv/cache --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub flake8 13:08:18 INFO - Using env: {'DISPLAY': ':0', 13:08:18 INFO - 'HOME': '/home/cltbld', 13:08:18 INFO - 'LANG': 'en_US.UTF-8', 13:08:18 INFO - 'LANGUAGE': 'en_US:en', 13:08:18 INFO - 'LOGNAME': 'cltbld', 13:08:18 INFO - 'MAIL': '/var/mail/cltbld', 13:08:18 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 13:08:18 INFO - 'MOZ_NO_REMOTE': '1', 13:08:18 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 13:08:18 INFO - 'NO_EM_RESTART': '1', 13:08:18 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 13:08:18 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 13:08:18 INFO - 'PWD': '/builds/slave/test', 13:08:18 INFO - 'SHELL': '/bin/bash', 13:08:18 INFO - 'SHLVL': '1', 13:08:18 INFO - 'TERM': 'linux', 13:08:18 INFO - 'TMOUT': '86400', 13:08:18 INFO - 'USER': 'cltbld', 13:08:18 INFO - 'XDG_SESSION_COOKIE': '3a3620fb28aea1604ab609ef000001d2-1452719001.9378-1378824880', 13:08:18 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 13:08:18 INFO - '_': '/tools/buildbot/bin/python'} 13:08:18 INFO - Ignoring indexes: https://pypi.python.org/simple/ 13:08:18 INFO - Downloading/unpacking flake8 13:08: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:08: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:08: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:08: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:08: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:08: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:08:20 INFO - Downloading flake8-2.5.0-py2.py3-none-any.whl 13:08:20 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fflake8-2.5.0-py2.py3-none-any.whl 13:08:20 INFO - Downloading/unpacking mccabe>=0.2.1,<0.4 (from flake8) 13:08: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:08: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:08: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:08: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:08: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:08: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:08:20 INFO - Downloading mccabe-0.3.1-py2.py3-none-any.whl 13:08:20 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fmccabe-0.3.1-py2.py3-none-any.whl 13:08:20 INFO - Downloading/unpacking pyflakes>=0.8.1,<1.1 (from flake8) 13:08: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:08: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:08: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:08: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:08: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:08: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:08:20 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fpyflakes-1.0.0-py2.py3-none-any.whl 13:08:20 INFO - Downloading/unpacking pep8>=1.5.7,!=1.6.0,!=1.6.1,!=1.6.2 (from flake8) 13:08: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:08: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:08: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:08: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:08: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:08: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:08:20 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fpep8-1.5.7.tar.gz 13:08:20 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/pep8/setup.py) egg_info for package pep8 13:08:20 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 13:08:20 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 13:08:20 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 13:08:20 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 13:08:20 INFO - no previously-included directories found matching 'docs/_build' 13:08:20 INFO - Installing collected packages: flake8, mccabe, pyflakes, pep8 13:08:21 INFO - Running setup.py install for pep8 13:08:21 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 13:08:21 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 13:08:21 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 13:08:21 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 13:08:21 INFO - no previously-included directories found matching 'docs/_build' 13:08:21 INFO - Installing pep8 script to /builds/slave/test/build/venv/bin 13:08:21 INFO - Successfully installed flake8 mccabe pyflakes pep8 13:08:21 INFO - Cleaning up... 13:08:21 INFO - Return code: 0 13:08:21 INFO - Running post-action listener: _resource_record_post_action 13:08:21 INFO - Running post-action listener: _start_resource_monitoring 13:08:21 INFO - Starting resource monitoring. 13:08:21 INFO - ##### 13:08:21 INFO - ##### Running install step. 13:08:21 INFO - ##### 13:08:21 INFO - Running pre-action listener: _resource_record_pre_action 13:08:21 INFO - Running main action method: install 13:08:21 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 13:08:21 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 13:08:21 INFO - Reading from file tmpfile_stdout 13:08:21 INFO - Detecting whether we're running mozinstall >=1.0... 13:08:21 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 13:08:21 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 13:08:21 INFO - Reading from file tmpfile_stdout 13:08:21 INFO - Output received: 13:08:21 INFO - Usage: mozinstall [options] installer 13:08:21 INFO - Options: 13:08:21 INFO - -h, --help show this help message and exit 13:08:21 INFO - -d DEST, --destination=DEST 13:08:21 INFO - Directory to install application into. [default: 13:08:21 INFO - "/builds/slave/test"] 13:08:21 INFO - --app=APP Application being installed. [default: firefox] 13:08:21 INFO - mkdir: /builds/slave/test/build/application 13:08:21 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '/builds/slave/test/build/firefox-46.0a1.en-US.linux-x86_64.tar.bz2', '--destination', '/builds/slave/test/build/application'] 13:08:21 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall /builds/slave/test/build/firefox-46.0a1.en-US.linux-x86_64.tar.bz2 --destination /builds/slave/test/build/application 13:08:37 INFO - Reading from file tmpfile_stdout 13:08:37 INFO - Output received: 13:08:37 INFO - /builds/slave/test/build/application/firefox/firefox 13:08:37 INFO - Running post-action listener: _resource_record_post_action 13:08:37 INFO - ##### 13:08:37 INFO - ##### Running run-tests step. 13:08:37 INFO - ##### 13:08:37 INFO - Running pre-action listener: _resource_record_pre_action 13:08:37 INFO - Running main action method: run_tests 13:08:37 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 13:08:37 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 13:08:37 INFO - Python 2.7.3 13:08:37 INFO - Return code: 0 13:08:37 INFO - grabbing minidump binary from tooltool 13:08:37 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 13:08:37 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 0x17423d0>, '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 0x16aded0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x16ae360>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 13:08:37 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:08:37 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:08:37 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 13:08:37 INFO - Return code: 0 13:08:37 INFO - Chmoding /builds/slave/test/build/linux64-minidump_stackwalk to 0755 13:08:37 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 13:08:37 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 13:08:37 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/linux64-minidump_stackwalk 13:08:37 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 13:08:37 INFO - Running command: ['/builds/slave/test/build/venv/bin/flake8', '/builds/slave/test/build/tests/talos/talos'] 13:08:37 INFO - Copy/paste: /builds/slave/test/build/venv/bin/flake8 /builds/slave/test/build/tests/talos/talos 13:08:38 INFO - Return code: 0 13:08:38 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Fx-Team-Non-PGO', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/Q-cw-MauRi-2bUM75RpNuA/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-059', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log'] in /builds/slave/test/build 13:08:38 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/tests/talos/talos/run_tests.py --branchName Fx-Team-Non-PGO --suite dromaeojs-e10s --executablePath /builds/slave/test/build/application/firefox/firefox --symbolsPath https://queue.taskcluster.net/v1/task/Q-cw-MauRi-2bUM75RpNuA/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.crashreporter-symbols.zip --title talos-linux64-ix-059 --webServer localhost --log-tbpl-level=debug --log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log --log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log 13:08:38 INFO - Using env: {'DISPLAY': ':0', 13:08:38 INFO - 'HOME': '/home/cltbld', 13:08:38 INFO - 'LANG': 'en_US.UTF-8', 13:08:38 INFO - 'LANGUAGE': 'en_US:en', 13:08:38 INFO - 'LOGNAME': 'cltbld', 13:08:38 INFO - 'MAIL': '/var/mail/cltbld', 13:08:38 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 13:08:38 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/linux64-minidump_stackwalk', 13:08:38 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 13:08:38 INFO - 'MOZ_NO_REMOTE': '1', 13:08:38 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 13:08:38 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 13:08:38 INFO - 'NO_EM_RESTART': '1', 13:08:38 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 13:08:38 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 13:08:38 INFO - 'PWD': '/builds/slave/test', 13:08:38 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 13:08:38 INFO - 'SHELL': '/bin/bash', 13:08:38 INFO - 'SHLVL': '1', 13:08:38 INFO - 'TERM': 'linux', 13:08:38 INFO - 'TMOUT': '86400', 13:08:38 INFO - 'USER': 'cltbld', 13:08:38 INFO - 'XDG_SESSION_COOKIE': '3a3620fb28aea1604ab609ef000001d2-1452719001.9378-1378824880', 13:08:38 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 13:08:38 INFO - '_': '/tools/buildbot/bin/python'} 13:08:38 INFO - Calling ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Fx-Team-Non-PGO', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/Q-cw-MauRi-2bUM75RpNuA/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-059', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log'] with output_timeout 3600 13:08:38 INFO - mozversion application_buildid: 20160113122832 13:08:38 INFO - mozversion application_changeset: 3a531aa40e497499331f462fad9349201c9d7d98 13:08:38 INFO - mozversion application_display_name: Nightly 13:08:38 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 13:08:38 INFO - mozversion application_name: Firefox 13:08:38 INFO - mozversion application_remotingname: firefox 13:08:38 INFO - mozversion application_repository: https://hg.mozilla.org/integration/fx-team 13:08:38 INFO - mozversion application_vendor: Mozilla 13:08:38 INFO - mozversion application_version: 46.0a1 13:08:38 INFO - mozversion platform_buildid: 20160113122832 13:08:38 INFO - mozversion platform_changeset: 3a531aa40e497499331f462fad9349201c9d7d98 13:08:38 INFO - mozversion platform_repository: https://hg.mozilla.org/integration/fx-team 13:08:38 INFO - mozversion platform_version: 46.0a1 13:08:38 INFO - using testdate: 1452719318 13:08:38 INFO - actual date: 1452719318 13:08:38 INFO - starting webserver on 'localhost:48718' 13:08:38 INFO - SUITE-START | Running 3 tests 13:08:38 INFO - TEST-START | dromaeo_css 13:08:38 INFO - operating with platform_type : linux_ 13:08:38 INFO - Initialising browser for dromaeo_css test... 13:08:38 INFO - TEST-INFO | started process 11732 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmp2eSOb5/profile http://localhost:48718/getInfo.html) 13:08:42 INFO - PROCESS | 11732 | 13:08:42 INFO - PROCESS | 11732 | (process:11813): GLib-CRITICAL **: g_path_get_basename: assertion `file_name != NULL' failed 13:08:43 INFO - PROCESS | 11732 | __metrics Screen width/height:1600/1200 13:08:43 INFO - PROCESS | 11732 | colorDepth:24 13:08:43 INFO - PROCESS | 11732 | Browser inner width/height: 1024/697 13:08:43 INFO - PROCESS | 11732 | __metrics 13:08:43 INFO - PROCESS | 11732 | JavaScript error: resource://gre/modules/PerformanceStats.jsm, line 211: NS_ERROR_NOT_AVAILABLE: Component returned failure code: 0x80040111 (NS_ERROR_NOT_AVAILABLE) [nsIPerformanceStatsService.isMonitoringJank] 13:08:44 INFO - TEST-INFO | 11732: exit 0 13:08:44 INFO - Browser initialized. 13:08:44 INFO - Running cycle 1/1 for dromaeo_css test... 13:08:44 INFO - TEST-INFO | started process 11862 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmp2eSOb5/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 13:08:46 INFO - PROCESS | 11862 | 13:08:46 INFO - PROCESS | 11862 | (process:11921): GLib-CRITICAL **: g_path_get_basename: assertion `file_name != NULL' failed 13:08:56 INFO - PROCESS | 11862 | RSS: Main: 150646784 13:08:56 INFO - PROCESS | 11862 | 13:09:46 INFO - PROCESS | 11862 | 1452719386222 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:11:57 INFO - PROCESS | 11862 | Cycle 1(1): loaded http://localhost:48718/tests/dromaeo/cssquery-dojo.html (next: http://localhost:48718/tests/dromaeo/cssquery-ext.html) 13:11:58 INFO - PROCESS | 11862 | RSS: Main: 152674304 13:11:58 INFO - PROCESS | 11862 | 13:15:00 INFO - PROCESS | 11862 | Cycle 1(1): loaded http://localhost:48718/tests/dromaeo/cssquery-ext.html (next: http://localhost:48718/tests/dromaeo/cssquery-jquery.html) 13:15:01 INFO - PROCESS | 11862 | RSS: Main: 151564288 13:15:01 INFO - PROCESS | 11862 | 13:18:03 INFO - PROCESS | 11862 | Cycle 1(1): loaded http://localhost:48718/tests/dromaeo/cssquery-jquery.html (next: http://localhost:48718/tests/dromaeo/cssquery-mootools.html) 13:18:03 INFO - PROCESS | 11862 | RSS: Main: 152322048 13:18:03 INFO - PROCESS | 11862 | 13:21:05 INFO - PROCESS | 11862 | Cycle 1(1): loaded http://localhost:48718/tests/dromaeo/cssquery-mootools.html (next: http://localhost:48718/tests/dromaeo/cssquery-prototype.html) 13:21:05 INFO - PROCESS | 11862 | RSS: Main: 149868544 13:21:05 INFO - PROCESS | 11862 | 13:24:08 INFO - PROCESS | 11862 | Cycle 1(1): loaded http://localhost:48718/tests/dromaeo/cssquery-prototype.html (next: http://localhost:48718/tests/dromaeo/cssquery-yui.html) 13:24:09 INFO - PROCESS | 11862 | RSS: Main: 151232512 13:24:09 INFO - PROCESS | 11862 | 13:27:11 INFO - PROCESS | 11862 | Cycle 1(1): loaded http://localhost:48718/tests/dromaeo/cssquery-yui.html (next: http://localhost:48718/tests/dromaeo/cssquery-dojo.html) 13:27:12 INFO - PROCESS | 11862 | RSS: Main: 152936448 13:27:12 INFO - PROCESS | 11862 | 13:27:12 INFO - PROCESS | 11862 | __start_tp_report 13:27:12 INFO - PROCESS | 11862 | _x_x_mozilla_page_load 13:27:12 INFO - PROCESS | 11862 | _x_x_mozilla_page_load_details 13:27:12 INFO - PROCESS | 11862 | |i|pagename|runs| 13:27:12 INFO - PROCESS | 11862 | |0;dojo.html;2621.7902567794554;2630.539655560277;2660.2152365052307;2685.9999999999986;2703.1214855172066;4367.366731823884;4522.773861306934;4555.886102847422;4556.384888040114;4579;4483.327500874871;4493.752843593601;4533;4569.794359253833;4570.885727856805;4207.831686732535;4217.198732240864;4274.252005898971;4281.015366465715;4330.805113769888;4221.0291632924445;4227.894302642428;4267.530571637118;4279.1441711657635;4295.849645262417;4110.157417729359;4138.420621113017;4176.519700234481;4182.20538097762;4193.329067349209;4179;4200.1179752252065;4205.411242426063;4210.221109094828;4229.048464095585;4169.854055108057;4175.3945677876845;4187.413762073312;4216.494020717533;4226.598473145046;4310.137972405531;4379.64962802975;4455.153520831064;4496.392986946753;4598.425196850394;4730.219513780222;4748.715077095385;4752.5247475252545;4755.334253204554;4775.5463230993;4788.856334309976;4797.472278049412;4802.5197480252045;4814.614830813526;4852.369192005052;4399.538048504893;4480.910381792379;4490.932636010462;4516.638668906479;4569.840055598104;4895.951040489549;4916.557509824133;4919.557239848431;4959.082569724613;4971.477994810492;4604;4743.31221972812;4743.430788305425;4751.477337492873;4802.063597598435;4743.905121897543;4790.904181916342;4796.856094317176;4840.878978025577;4884.316195732529;4776.641751868624;4786.329913812069;4792.616590672737;4793.9280910786365;4837.250226214942;4627.3521706961055;4702.88242793926;4743.833965811249;4783.1390349737385;4800.5199480052415;4011.29802284599;4041.2321658885307;4050.270951228807;4078.938815917764;4093.4473846031;3533.5936367318086;3538.0447279234463;3559.964400356015;3577.606463289036;3585.4263317869018;4069.1658210066867;4149.3775933609595;4192.769397683096;4203.432536607519;4208.705390622627;4885.047415753965;4886.731229782325;4891.388576427947;4912.95087049125;4921.311016457699;4174.812133454002;4213.367994800805;4216.987922898482;4222.831086756557;4253.149370125987;4190.601892820177;4245.830166793294;4303.548127446636;4308.353746937984;4404.053128577371;4501.3022981437925;4514.052049069732;4526.977365113154;4530.524294949048;4566.474855391606;4816.060868130681;4820.71075735457;4820.9517904821905;4823.975880120577;4855.2717092435005;4457.621102206349;4525.411696479437;4603.033362993809;4627.444706635225;4665.973485833111;4745.217039188496;4746.596539294061;4757.476677565396;4758.072175925661;4777.761111944319;4771.928421073617;4832.492588278321;4834.444038935568;4859.95140048595;4872.025594881109;4683.531646835289;4757.762111894461;4788.11419887322;4792.640551958547;4816.590589799906;4735.313379560013;4753.952460475351;4775.379200703886;4791.880202994814;4808.903821923612;4496.527864574173;4603.171429142786;4690.530946905282;4693.061387722538;4738.7867545959825;4661.30080487916;4794.2808578713475;4801.423829140525;4837.733924634179;4849.369581954324;4655;4665.113628410591;4670.9766451167525;4673.532646735299;4680.672352935262 13:27:12 INFO - PROCESS | 11862 | |1;ext.html;499.340870051532;502.7913415932388;529.4546616984506;530.8221745715185;544.6242092955857;33373.83313083434;34656.30687386251;34661.13347166322;34679.30641387171;34704.826475867616;35877;36144.2771144577;36329.27341453176;36394.27211455776;36435.63564364355;7329.926700732991;7494.850102997937;7504.212057733941;7519.887201691951;7531.2468753124795;7644.312011918926;7732.690692372326;7774.766756997299;7776.533407995538;7828.608569571527;7704.576248306341;7757.728479503218;7801.063872335328;7823.687052517893;7825.569593672346;7727.497712648688;7769.145394006655;7778.49439786412;7821.648025838851;7831.334336581341;7582.772516824504;7729.304362607336;7731.304182623591;7737.57443340616;7771.106322772897;33249.168770780685;33615.6638433615;33700;33733.493997590056;33881.83059084714;2873.540233562641;2948.7051294870344;2952.8228306301476;2973.6580293266334;3136.764742644288;27279;27676.584851227246;27775.305617359525;27951.161465156078;28525.714742852513;3367.6632336766374;3386.1365351835125;3386.6613338666184;3462.5325581046486;3545.2377738786286;162297.18851405787;163902.1804890968;164050;164275;165153;46533.53466465292;47330.76334618374;50366.244506332434;55179;56315;48309.75845120752;48509.75745121252;48538.27192592114;48726.51273487291;48746.75626621844;12761.808572871414;12770.80843787344;12850.164739291917;12872.22766634005;13037.804432933513;10230.590776368861;10231.744206394751;10235.078842904026;10245.129164021142;10266;18222.544436388933;18343.35798247055;18402.35591754282;18449.631007379776;18488.72266915997;7594.468387212842;7745.573993430416;7868.370530357558;7927.207279272026;7944.84110317802;746.305935479998;802.7110240313483;843.4348986179275;857.7984173719171;891.80826122384;23145.421364466023;23453.530929381315;24548.140815071387;24703.50592988166;24792.876035619705;967.874176357069;968.1190116993503;978.5351957819978;993.7416271769392;1017.8269694152012;12156.5137394505;12174.57388991381;12260.386980650932;12271;12309.446074926649;305087;309011;309517;310022;310159;46869;47448.28827567589;47471.76264118657;47518;47520.5247947523;1193.242291145129;1212.2120621595857;1225.993870030662;1231.5258625429274;1233.969150771238;24210.273691789276;25020.62469062929;25131.87434062818;25210.243692689248;25371.238862834143;35240.47139292964;35413.82293088518;35725;35739;35800.28399432049;239458;241735;242388;242391;242621;28367.723452444276;37837.24325513419;38152;38523;38664.6133538661;33450.163745906546;33905.32189356248;34244.65755342415;34261.72568030166;34366.14084647904;30148.547771783004;31136.688633114285;31962.52056219112;32427.513587296682;32520.674793251765;31508;31956.840215798773;32083.35833283368;32710.182245444055;34246.48630270498;31829.522557162123;31975;32650.183745406553;32781.18047048843;32781.672183277864;28727.712722872504;28739.28151796222;30131.698683012888;30220.84889575538;30563;23908;24154.275371738877;24500.632490513013;24835;24883.377915552257 13:27:12 INFO - PROCESS | 11862 | |2;jquery.html;341.60203363081996;343.63231342463564;347.260335485416;348.0637086238018;348.16440542697524;13768.793468097974;13842;14971.625709357271;15613.609659758484;16103.999999999985;10334.793304133913;10578.78842423151;12980;15258.313375898084;15333.463328783495;4428.914915845614;4519.2995085761595;4604.056168485469;4925.310456536088;4930.112579735646;4849.224124140138;4918.458969513351;4958.950410495903;4978.5270399312185;5000.374953130859;4517.616002639779;4891.926621100669;4953.182724850395;5078.669886457368;5083.872903177413;4885.218365061609;4947.257911313296;4991.126552853254;5022.447530771612;5198.610104242159;5036.320096786923;5056.84829455117;5071.366079240095;5074.720890351029;5076.086304465195;10605.098566621846;15920.52238432849;17619.471415857544;18242.63514729711;18271.44692701122;1759.0852756566642;1804.7022241330164;1812.8368446839715;1823.8358547730768;1827.8263564961308;8981.191692747683;11281.887181128248;11974.22167559106;12219.511219551207;12221.511139554406;1677.211710496077;1746.1792957310172;1760.6390689908537;1765.4438851761781;1786.214065811039;48627.513724863005;49925.500744992445;50245.497545024446;50671.23993140106;50855.74572127152;9326.487043212688;9548.092931171528;9555.140037396528;9641.084097010773;9643.517824108767;12120.212186207867;12138.150329476852;12143.757124857453;12148.635540933787;12167.878321216851;6878.8624227515165;6990.300969903071;7061.858762824818;7097.432205423554;7106.5736055836815;6668.466522678174;6687.799366019027;6729.831754206086;6751.594904305757;6757.121574195323;3968.0476685595827;4062.5531191568903;4113.197926404382;4115.73247738896;4142.357934520154;1642.1789105447276;1772.0962309222389;1786.9992804029785;1797.2631221199244;1798.8740788144967;811.5130921447085;908.6365453818394;912.3248795890993;915.1489115122866;976.6728146071146;11844.348560829065;13886.513972010931;13950.977108319237;13993.30033498321;14437.494687685881;807.2936180841764;861.1388611388611;863.1541089732098;875.5797217335714;899.3839220134229;8234.547099909443;8299.170082991652;8457.281131103802;8622.26710729595;8731.650733970697;386219;388037;416351;434097;439293;37866.62133378686;58938;58961;59813.70093149506;60255.397446025854;1049.7847941172042;1051.9789604207872;1061.7823346214007;1068.2949253492657;1083.4799296337644;13221.735565288833;13230.206187628773;13290;13304.667383315495;13478.32608369558;28321.858390707916;28342.433151336445;28384.858075710315;28658.570121447778;28711.282217944718;34998.82500587481;35448.645513544536;36232.456513151796;36390.63609363978;37528;6343;6352.491800655844;6590.8352291193105;6621.370969757865;6730.528862979741;8533.658653653783;9668.516574171404;9681.612735490784;9898.10917017472;10522.31604945676;8043.517388956681;8594.183552562497;8594.226519613265;8709.433886797338;8824;8627.568621569022;8901.910980890108;9029.36794424384;9418.905810941802;9500.144986951207;8840.602172902107;8954.552272386485;9187.127222913812;9267.073292670948;9297.86053209216;6597.373249541286;6607.9669601651685;6851.931480685129;6876.69054892541;6883.105196324445;7742.65158067877;8082.7171049013;8310.958445207736;8362.958185209034;8374.413791034569 13:27:12 INFO - PROCESS | 11862 | |3;mootools.html;1385.4735200623766;1410.8377536583293;1520.3386526860816;1693.8136804951446;1712.1011468978793;5930.258717660293;6058.7879424220055;6508.414242718154;6647.933520664798;6689.163854518185;6445.742170313182;6553.082568440422;6611.173603299588;6654.966725166368;6659.667016649172;2053.6303465376227;2086.1968142265187;2089.759677637076;2090.4878304815265;2093.005822234442;1958.7845337012918;1976.6244413561449;1986.682130859063;1989.6020795840818;1994.3618042226494;2015.6472617291988;2048.5595596946655;2056.9485762855898;2064.194963964055;2091.435312465633;2088.853780235384;2090.2788537954457;2092.7593326767465;2094.413564202026;2096.75887272964;2004.9599008019904;2018.7981201879695;2049.5388537578924;2056.0953180600486;2057.0537552725764;6932.029515867783;6945.548539344926;6952.721891124349;6960.512764106515;6995.8950615740805;3952.130531283113;4031.516218053823;4035.3341698619693;4039.252738243405;4043.4945631796027;2566.8459892406518;2584.754448327406;2585.263199988013;2747.409306999005;2747.587861820723;813.829095889858;834.2283387866261;838.1325328285257;841.6197436204629;1752.6056637256643;8752.037275899645;8771.956140219258;8818.030016698158;8840.646374145026;8875.112488751138;3463.8268086595567;3511.1573222426946;3540;3553.697935675445;3590.120420496995;7284.745033923788;7346.1551921528635;7347.08161479815;7380.852382952311;7389.926100739031;3956.1098752780968;3967.107400834789;3971.285168669667;3995.220931918306;3999.200159968018;3284.5894263217097;3359.613644430922;3705.09225239818;3714.888553343404;3747.0819649186124;3108.129723677374;3128.5307203919137;3144.701253380925;3145.6067991501063;3167.524871269282;918.2195134135931;936.8782058332373;937.1799675284126;940.1632547033146;957.9089986451276;970.8301047316692;982.474376208725;1001.689476262361;1005.6982905128432;1007.3552926127285;6335.936640633535;6364.64994425311;6397.168368112209;6398.424141827258;6405.48756099511;401.1075357329918;406.4918851435705;411.1284077755178;412.8039181388816;413.51825123730515;5135.6148288878485;5235.633505654644;5244.423113457517;5259.868503287372;5283.181106928432;7574.242575742492;7643.69425222996;7847.9607601961625;7861.056673199253;7882.172371900868;7763.689452421952;7780.4553681242905;7828.099768526692;7846.568438735811;7849.215078492105;6064.9090263646085;6205.472534834499;6217.751289948352;6223.253209614875;6245.906311405332;6361.586496877688;6405.711742971671;6427.292997770148;6445.12990746262;6450.516211284079;7053.506254562337;7155.069840920647;7403.851922961619;7423.406127509894;7472.364848987897;7422.183559808309;7555.773326800205;7572.7728168155045;7625.733099341496;7714.421418393756;5262.105442074933;5407.594430417813;5911.3201981772645;6083.604565703392;6087.756489740361;6020.9764340063175;6066.423689749467;6066.878662426815;6067.939320606737;6075.36208698098;5813.593048486566;5921.940780592311;5925.200097986889;6007.609505382311;6110.572259941761;5622.85942851432;5736;5817.0983497557945;5924.140999555127;5927.377625349276;5900.734466949083;6066;6100.176476175837;6172.783952561639;6204.224471941007;5595.63628364155;5637.774489020393;5685.545156387397;5701.486866182064;5704.258446401941;5718.771249149988;5730.054541000688;5731.656100633975;5733.2260144881575;5745.770169193185 13:27:12 INFO - PROCESS | 11862 | |4;prototype.html;296.2445763303576;305.57067320414825;308.1018830110229;309.32875659818177;312.46412402729317;5499.807506737265;5564.360098588659;5574.916376254359;5657.292838395206;5739.426057394258;5547.805826796063;5599.076152434844;5615.522680572146;5618.381977982429;5619.381867994517;4048.67610591152;4141.378793181017;4244.511881133678;4287.699861009731;4290.442242508478;4149.564295748948;4252.170826688797;4252.255855225339;4258.276093064171;4281.914361712764;4247.766372849492;4257.425247591582;4258.680598955075;4260.02019535507;4263.2965560682605;4241.681873859473;4253.617174454314;4261.914761704748;4264.147170565884;4267.594578515036;3679.6504332088407;3682.760620559655;3692.7415080944343;3694.1688120173017;3703.129764505339;5175;5247.711375874325;5337.092694241988;5364.839054828361;5365.141577347606;4872.634552408548;4892.192788189945;4893.314935908976;4896.412430508326;4898.681585696918;5851.093080572518;5874.412558744134;5895.528357731371;5921.023031199847;5937.881242375129;3807.124361396894;4014.698897582664;4015.6185162409524;4017.4978127734034;4023.2154729827694;6007.128966299906;6211.378862113753;6221.408966148254;6233.065040243954;6236.033414820756;4069.206504731608;4087.795610219477;4112.239235741397;4122.319817230184;4131.173765246903;4144.834206631701;4172.144710334374;4178.143480586473;4178.22702799983;4197;4749.525047495292;4851.975740121347;4852.053849499384;4852.830150944771;4855.441624213261;5864.765409383577;5874.913141068831;5888.087346461305;5911.615744976562;5919.822405327847;1448.1021766504623;1486.5466032860081;1486.6580686442178;1487.5760408283588;1487.8660920517204;972.9270304727174;974.8196583632051;975.0298453039271;980.7352014955922;983.5475681186734;5115.514026167582;5119.283300337956;5128.512791284822;5128.8461346159675;5129.512696293846;6123.540734444845;6138.324784273726;6146.846328841814;6146.969265153645;6149.108379284979;5102.285680004802;5108.182690769459;5117.130087885069;5131.153359695609;5132.948670513247;3269.800679928216;3284.7372210223125;3316.2372654289647;3346.8828590999196;3348.2131699050706;5609.186667933127;5739.16782066598;5746.109353050284;5753.741081651336;5753.971230143822;6359.618422894641;6360.141380913517;6379.043143528508;6394.552381333262;6403.967980160162;5767;5779.595428319977;5785.971070144622;5793.652380857162;5795.971020144957;6168.414000669929;6186.257649082139;6206.565540412128;6211.223597050369;6220.471259942956;5822.970885145547;6042.728077236623;6077.787277445268;6078.240219972504;6084.361142080018;5784.1034639630925;5784.4504772046585;5794.82615521535;5802.100674395476;5807.564432667651;4029.6373326400767;4121.216968776042;4126.855560055384;4127.463429754112;4136.276151673505;6067.150598916067;6188.9690551546955;6193.327801493661;6200.286966998853;6202.782902598387;5961.761529538943;5969.8806023878415;5973.940260597512;5978.312494063064;5981.252343457068;5915.201447804491;5948.672822994777;5964.850878727893;6029.547783916311;6051.425114614105;5732.398098199629;5754.108113242454;5798.275215598051;5819.243498345188;5849.181114644039;5956.731947062306;5978.252718410199;5984.072468767348;5987.221661184192;5991.101334799815;5762.7694892203845;5774.48029677331;5811.953848307346;5814.738336774771;5823.941760582509 13:27:12 INFO - PROCESS | 11862 | |5;yui.html;726.7093162734906;733.5452019747758;769.3883362726632;779.582923136122;781.4646966827723;10851.782964340708;10973.945130274358;10976.396298203596;10983;10986;11193.328400295988;11218.831717524243;11222.887771122307;11234.831477527823;11267.323960562371;768.8731359325704;775.751759436979;791.4143533785016;805.6898094233703;805.7784109369911;781.269513005339;785.6857257097149;790.3835008693228;791.1692722641233;793.6111305460312;826.6362800367818;829.0341751859077;829.7261903571837;830.0578843013193;832.5254604875223;819.5041999590252;819.635262308273;819.6516480495766;821.8685010398367;823.9464434811719;598.3059650805045;600.7236671131285;603.1013789453726;607.5504126946072;612.0574315554042;12293.508259669692;12368.319742414164;12400.689982750504;12439.191452555646;12448.190867593577;11418.600348987746;11495.655130346104;11744.823827642593;11751.06875182671;11886.40567971598;9587.616495340179;9648.083432073941;9781.51092445382;9860.112589866874;9863.60545578176;3181.1812408693736;3190.441672707267;3205.102571280045;3236.7086962173516;3277.7869438486423;40851;41019;41517.1696566067;41610;41631.58368416307;9332.486713230837;9350.345475816763;9421.152096311365;9512.334136610509;9531.523423828781;15779.763303550455;15831;15887.443939462064;15966.76049859253;15975.840241597667;6415.390537898892;6529.902051469232;6534.150560427209;6534.575252608565;6780.796576102724;3502.5446691929887;3599.028262369198;3706.5737440194184;3717.3617126593244;3784.413415920537;2451.105346548497;2592.2223333000024;2622.462395208978;2626.7898568114506;2627.1724406811795;484.10264566569055;485.1437213318496;485.94411642661544;489.0902920567741;489.7600175913777;426.73968878983794;441.35782436555377;494.78971437139074;502.4121777520237;531.2031952071892;6352.460040896575;6726.966365168143;6805.795826125224;6847.657617119125;6881.759138430231;544.7330807904099;545.6671430427436;550.7741825851382;553.5986409852904;562.2830890614417;3317.270200555874;3404.438267685804;3409.301093275922;3804.961950380516;3814.3324918139215;39485.80257098754;40017.79991100084;40101.799491002945;40195.598044019185;40239;40406.19187616231;40888.38667419991;41651.16697666029;41939;42630.57369426328;35176.82411587977;35247.118822029144;37946.24107517834;39469;39587;8255.669773209245;8379.413441059067;8387.580620969049;8419.494830310201;8506.021807492218;29211.415771684024;29437.85281073581;30221.244468888453;30424.239394015327;30473;32195.678043219268;33346.33307333888;33571.160720982174;33589.49615755815;37936.43095353627;9445.48049857237;9708.320417570701;9929.205483829188;10078.496075196064;10116.494175291353;11200.83198752003;11352.829707554558;11496.195266331277;11517.021053210236;11681.532738690357;9897.950510247403;9994.400335979864;10390.636327728493;10656;10799.784004320027;9974.850377244493;10019.398836069859;10078.748031298983;10092.394456332644;10358.119559837498;8935.955320223356;9550.18823399991;9608.75978100553;9716.174125199437;10598.364098154136;8403.915960840557;8458.830823383621;8465.36509761758;8509.038007630088;8763.561821909007;8438.789030274293;8790;8805.16350946659;8863.778405539913;8957.372983891066 13:27:12 INFO - PROCESS | 11862 | __end_tp_report 13:27:12 INFO - PROCESS | 11862 | __start_cc_report 13:27:12 INFO - PROCESS | 11862 | _x_x_mozilla_cycle_collect,314 13:27:12 INFO - PROCESS | 11862 | __end_cc_report 13:27:12 INFO - PROCESS | 11862 | __startTimestamp1452720432047__endTimestamp 13:27:12 INFO - PROCESS | 11862 | 13:27:12 INFO - PROCESS | 11862 | ------- Summary: start ------- 13:27:12 INFO - PROCESS | 11862 | Number of tests: 6 13:27:12 INFO - PROCESS | 11862 | 13:27:12 INFO - PROCESS | 11862 | [#0] dojo.html Cycles:165 Average:4474.01 Median:4598.43 stddev:446.41 (9.7%) stddev-sans-first:423.48 13:27:12 INFO - PROCESS | 11862 | Values: 2621.8 2630.5 2660.2 2686.0 2703.1 4367.4 4522.8 4555.9 4556.4 4579.0 4483.3 4493.8 4533.0 4569.8 4570.9 4207.8 4217.2 4274.3 4281.0 4330.8 4221.0 4227.9 4267.5 4279.1 4295.8 4110.2 4138.4 4176.5 4182.2 4193.3 4179.0 4200.1 4205.4 4210.2 4229.0 4169.9 4175.4 4187.4 4216.5 4226.6 4310.1 4379.6 4455.2 4496.4 4598.4 4730.2 4748.7 4752.5 4755.3 4775.5 4788.9 4797.5 4802.5 4814.6 4852.4 4399.5 4480.9 4490.9 4516.6 4569.8 4896.0 4916.6 4919.6 4959.1 4971.5 4604.0 4743.3 4743.4 4751.5 4802.1 4743.9 4790.9 4796.9 4840.9 4884.3 4776.6 4786.3 4792.6 4793.9 4837.3 4627.4 4702.9 4743.8 4783.1 4800.5 4011.3 4041.2 4050.3 4078.9 4093.4 3533.6 3538.0 3560.0 3577.6 3585.4 4069.2 4149.4 4192.8 4203.4 4208.7 4885.0 4886.7 4891.4 4913.0 4921.3 4174.8 4213.4 4217.0 4222.8 4253.1 4190.6 4245.8 4303.5 4308.4 4404.1 4501.3 4514.1 4527.0 4530.5 4566.5 4816.1 4820.7 4821.0 4824.0 4855.3 4457.6 4525.4 4603.0 4627.4 4666.0 4745.2 4746.6 4757.5 4758.1 4777.8 4771.9 4832.5 4834.4 4860.0 4872.0 4683.5 4757.8 4788.1 4792.6 4816.6 4735.3 4754.0 4775.4 4791.9 4808.9 4496.5 4603.2 4690.5 4693.1 4738.8 4661.3 4794.3 4801.4 4837.7 4849.4 4655.0 4665.1 4671.0 4673.5 4680.7 13:27:12 INFO - PROCESS | 11862 | 13:27:12 INFO - PROCESS | 11862 | [#1] ext.html Cycles:180 Average:39148.61 Median:18533.83 stddev:64253.42 (346.7%) stddev-sans-first:64368.14 13:27:12 INFO - PROCESS | 11862 | Values: 499.3 502.8 529.5 530.8 544.6 33373.8 34656.3 34661.1 34679.3 34704.8 35877.0 36144.3 36329.3 36394.3 36435.6 7329.9 7494.9 7504.2 7519.9 7531.2 7644.3 7732.7 7774.8 7776.5 7828.6 7704.6 7757.7 7801.1 7823.7 7825.6 7727.5 7769.1 7778.5 7821.6 7831.3 7582.8 7729.3 7731.3 7737.6 7771.1 33249.2 33615.7 33700.0 33733.5 33881.8 2873.5 2948.7 2952.8 2973.7 3136.8 27279.0 27676.6 27775.3 27951.2 28525.7 3367.7 3386.1 3386.7 3462.5 3545.2 162297.2 163902.2 164050.0 164275.0 165153.0 46533.5 47330.8 50366.2 55179.0 56315.0 48309.8 48509.8 48538.3 48726.5 48746.8 12761.8 12770.8 12850.2 12872.2 13037.8 10230.6 10231.7 10235.1 10245.1 10266.0 18222.5 18343.4 18402.4 18449.6 18488.7 7594.5 7745.6 7868.4 7927.2 7944.8 746.3 802.7 843.4 857.8 891.8 23145.4 23453.5 24548.1 24703.5 24792.9 967.9 968.1 978.5 993.7 1017.8 12156.5 12174.6 12260.4 12271.0 12309.4 305087.0 309011.0 309517.0 310022.0 310159.0 46869.0 47448.3 47471.8 47518.0 47520.5 1193.2 1212.2 1226.0 1231.5 1234.0 24210.3 25020.6 25131.9 25210.2 25371.2 35240.5 35413.8 35725.0 35739.0 35800.3 239458.0 241735.0 242388.0 242391.0 242621.0 28367.7 37837.2 38152.0 38523.0 38664.6 33450.2 33905.3 34244.7 34261.7 34366.1 30148.5 31136.7 31962.5 32427.5 32520.7 31508.0 31956.8 32083.4 32710.2 34246.5 31829.5 31975.0 32650.2 32781.2 32781.7 28727.7 28739.3 30131.7 30220.8 30563.0 23908.0 24154.3 24500.6 24835.0 24883.4 13:27:12 INFO - PROCESS | 11862 | 13:27:12 INFO - PROCESS | 11862 | [#2] jquery.html Cycles:180 Average:22326.13 Median:4927.71 stddev:67455.06 (1368.9%) stddev-sans-first:67624.09 13:27:12 INFO - PROCESS | 11862 | Values: 341.6 343.6 347.3 348.1 348.2 13768.8 13842.0 14971.6 15613.6 16104.0 10334.8 10578.8 12980.0 15258.3 15333.5 4428.9 4519.3 4604.1 4925.3 4930.1 4849.2 4918.5 4959.0 4978.5 5000.4 4517.6 4891.9 4953.2 5078.7 5083.9 4885.2 4947.3 4991.1 5022.4 5198.6 5036.3 5056.8 5071.4 5074.7 5076.1 10605.1 15920.5 17619.5 18242.6 18271.4 1759.1 1804.7 1812.8 1823.8 1827.8 8981.2 11281.9 11974.2 12219.5 12221.5 1677.2 1746.2 1760.6 1765.4 1786.2 48627.5 49925.5 50245.5 50671.2 50855.7 9326.5 9548.1 9555.1 9641.1 9643.5 12120.2 12138.2 12143.8 12148.6 12167.9 6878.9 6990.3 7061.9 7097.4 7106.6 6668.5 6687.8 6729.8 6751.6 6757.1 3968.0 4062.6 4113.2 4115.7 4142.4 1642.2 1772.1 1787.0 1797.3 1798.9 811.5 908.6 912.3 915.1 976.7 11844.3 13886.5 13951.0 13993.3 14437.5 807.3 861.1 863.2 875.6 899.4 8234.5 8299.2 8457.3 8622.3 8731.7 386219.0 388037.0 416351.0 434097.0 439293.0 37866.6 58938.0 58961.0 59813.7 60255.4 1049.8 1052.0 1061.8 1068.3 1083.5 13221.7 13230.2 13290.0 13304.7 13478.3 28321.9 28342.4 28384.9 28658.6 28711.3 34998.8 35448.6 36232.5 36390.6 37528.0 6343.0 6352.5 6590.8 6621.4 6730.5 8533.7 9668.5 9681.6 9898.1 10522.3 8043.5 8594.2 8594.2 8709.4 8824.0 8627.6 8901.9 9029.4 9418.9 9500.1 8840.6 8954.6 9187.1 9267.1 9297.9 6597.4 6608.0 6851.9 6876.7 6883.1 7742.7 8082.7 8311.0 8363.0 8374.4 13:27:12 INFO - PROCESS | 11862 | 13:27:12 INFO - PROCESS | 11862 | [#3] mootools.html Cycles:180 Average:4662.00 Median:5906.03 stddev:2382.24 (40.3%) stddev-sans-first:2376.20 13:27:12 INFO - PROCESS | 11862 | Values: 1385.5 1410.8 1520.3 1693.8 1712.1 5930.3 6058.8 6508.4 6647.9 6689.2 6445.7 6553.1 6611.2 6655.0 6659.7 2053.6 2086.2 2089.8 2090.5 2093.0 1958.8 1976.6 1986.7 1989.6 1994.4 2015.6 2048.6 2056.9 2064.2 2091.4 2088.9 2090.3 2092.8 2094.4 2096.8 2005.0 2018.8 2049.5 2056.1 2057.1 6932.0 6945.5 6952.7 6960.5 6995.9 3952.1 4031.5 4035.3 4039.3 4043.5 2566.8 2584.8 2585.3 2747.4 2747.6 813.8 834.2 838.1 841.6 1752.6 8752.0 8772.0 8818.0 8840.6 8875.1 3463.8 3511.2 3540.0 3553.7 3590.1 7284.7 7346.2 7347.1 7380.9 7389.9 3956.1 3967.1 3971.3 3995.2 3999.2 3284.6 3359.6 3705.1 3714.9 3747.1 3108.1 3128.5 3144.7 3145.6 3167.5 918.2 936.9 937.2 940.2 957.9 970.8 982.5 1001.7 1005.7 1007.4 6335.9 6364.6 6397.2 6398.4 6405.5 401.1 406.5 411.1 412.8 413.5 5135.6 5235.6 5244.4 5259.9 5283.2 7574.2 7643.7 7848.0 7861.1 7882.2 7763.7 7780.5 7828.1 7846.6 7849.2 6064.9 6205.5 6217.8 6223.3 6245.9 6361.6 6405.7 6427.3 6445.1 6450.5 7053.5 7155.1 7403.9 7423.4 7472.4 7422.2 7555.8 7572.8 7625.7 7714.4 5262.1 5407.6 5911.3 6083.6 6087.8 6021.0 6066.4 6066.9 6067.9 6075.4 5813.6 5921.9 5925.2 6007.6 6110.6 5622.9 5736.0 5817.1 5924.1 5927.4 5900.7 6066.0 6100.2 6172.8 6204.2 5595.6 5637.8 5685.5 5701.5 5704.3 5718.8 5730.1 5731.7 5733.2 5745.8 13:27:12 INFO - PROCESS | 11862 | 13:27:12 INFO - PROCESS | 11862 | [#4] prototype.html Cycles:180 Average:4868.31 Median:5612.35 stddev:1467.43 (26.1%) stddev-sans-first:1430.86 13:27:12 INFO - PROCESS | 11862 | Values: 296.2 305.6 308.1 309.3 312.5 5499.8 5564.4 5574.9 5657.3 5739.4 5547.8 5599.1 5615.5 5618.4 5619.4 4048.7 4141.4 4244.5 4287.7 4290.4 4149.6 4252.2 4252.3 4258.3 4281.9 4247.8 4257.4 4258.7 4260.0 4263.3 4241.7 4253.6 4261.9 4264.1 4267.6 3679.7 3682.8 3692.7 3694.2 3703.1 5175.0 5247.7 5337.1 5364.8 5365.1 4872.6 4892.2 4893.3 4896.4 4898.7 5851.1 5874.4 5895.5 5921.0 5937.9 3807.1 4014.7 4015.6 4017.5 4023.2 6007.1 6211.4 6221.4 6233.1 6236.0 4069.2 4087.8 4112.2 4122.3 4131.2 4144.8 4172.1 4178.1 4178.2 4197.0 4749.5 4852.0 4852.1 4852.8 4855.4 5864.8 5874.9 5888.1 5911.6 5919.8 1448.1 1486.5 1486.7 1487.6 1487.9 972.9 974.8 975.0 980.7 983.5 5115.5 5119.3 5128.5 5128.8 5129.5 6123.5 6138.3 6146.8 6147.0 6149.1 5102.3 5108.2 5117.1 5131.2 5132.9 3269.8 3284.7 3316.2 3346.9 3348.2 5609.2 5739.2 5746.1 5753.7 5754.0 6359.6 6360.1 6379.0 6394.6 6404.0 5767.0 5779.6 5786.0 5793.7 5796.0 6168.4 6186.3 6206.6 6211.2 6220.5 5823.0 6042.7 6077.8 6078.2 6084.4 5784.1 5784.5 5794.8 5802.1 5807.6 4029.6 4121.2 4126.9 4127.5 4136.3 6067.2 6189.0 6193.3 6200.3 6202.8 5961.8 5969.9 5973.9 5978.3 5981.3 5915.2 5948.7 5964.9 6029.5 6051.4 5732.4 5754.1 5798.3 5819.2 5849.2 5956.7 5978.3 5984.1 5987.2 5991.1 5762.8 5774.5 5812.0 5814.7 5823.9 13:27:12 INFO - PROCESS | 11862 | 13:27:12 INFO - PROCESS | 11862 | [#5] yui.html Cycles:180 Average:11534.04 Median:21535.97 stddev:12481.06 (58.0%) stddev-sans-first:12489.68 13:27:12 INFO - PROCESS | 11862 | Values: 726.7 733.5 769.4 779.6 781.5 10851.8 10973.9 10976.4 10983.0 10986.0 11193.3 11218.8 11222.9 11234.8 11267.3 768.9 775.8 791.4 805.7 805.8 781.3 785.7 790.4 791.2 793.6 826.6 829.0 829.7 830.1 832.5 819.5 819.6 819.7 821.9 823.9 598.3 600.7 603.1 607.6 612.1 12293.5 12368.3 12400.7 12439.2 12448.2 11418.6 11495.7 11744.8 11751.1 11886.4 9587.6 9648.1 9781.5 9860.1 9863.6 3181.2 3190.4 3205.1 3236.7 3277.8 40851.0 41019.0 41517.2 41610.0 41631.6 9332.5 9350.3 9421.2 9512.3 9531.5 15779.8 15831.0 15887.4 15966.8 15975.8 6415.4 6529.9 6534.2 6534.6 6780.8 3502.5 3599.0 3706.6 3717.4 3784.4 2451.1 2592.2 2622.5 2626.8 2627.2 484.1 485.1 485.9 489.1 489.8 426.7 441.4 494.8 502.4 531.2 6352.5 6727.0 6805.8 6847.7 6881.8 544.7 545.7 550.8 553.6 562.3 3317.3 3404.4 3409.3 3805.0 3814.3 39485.8 40017.8 40101.8 40195.6 40239.0 40406.2 40888.4 41651.2 41939.0 42630.6 35176.8 35247.1 37946.2 39469.0 39587.0 8255.7 8379.4 8387.6 8419.5 8506.0 29211.4 29437.9 30221.2 30424.2 30473.0 32195.7 33346.3 33571.2 33589.5 37936.4 9445.5 9708.3 9929.2 10078.5 10116.5 11200.8 11352.8 11496.2 11517.0 11681.5 9898.0 9994.4 10390.6 10656.0 10799.8 9974.9 10019.4 10078.7 10092.4 10358.1 8936.0 9550.2 9608.8 9716.2 10598.4 8403.9 8458.8 8465.4 8509.0 8763.6 8438.8 8790.0 8805.2 8863.8 8957.4 13:27:12 INFO - PROCESS | 11862 | -------- Summary: end -------- 13:27:12 INFO - PROCESS | 11862 | 13:27:12 INFO - TEST-INFO | 11862: exit 0 13:27:12 INFO - TEST-OK | dromaeo_css | took 1114425ms 13:27:12 INFO - TEST-START | kraken 13:27:12 INFO - operating with platform_type : linux_ 13:27:12 INFO - Initialising browser for kraken test... 13:27:12 INFO - TEST-INFO | started process 12103 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmp_1zctN/profile http://localhost:48718/getInfo.html) 13:27:16 INFO - PROCESS | 12103 | 13:27:16 INFO - PROCESS | 12103 | (process:12174): GLib-CRITICAL **: g_path_get_basename: assertion `file_name != NULL' failed 13:27:17 INFO - PROCESS | 12103 | __metrics Screen width/height:1600/1200 13:27:17 INFO - PROCESS | 12103 | colorDepth:24 13:27:17 INFO - PROCESS | 12103 | Browser inner width/height: 1024/697 13:27:17 INFO - PROCESS | 12103 | __metrics 13:27:17 INFO - PROCESS | 12103 | JavaScript error: resource://gre/modules/PerformanceStats.jsm, line 211: NS_ERROR_NOT_AVAILABLE: Component returned failure code: 0x80040111 (NS_ERROR_NOT_AVAILABLE) [nsIPerformanceStatsService.isMonitoringJank] 13:27:18 INFO - TEST-INFO | 12103: exit 0 13:27:18 INFO - Browser initialized. 13:27:18 INFO - Running cycle 1/1 for kraken test... 13:27:18 INFO - TEST-INFO | started process 12223 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmp_1zctN/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 13:27:20 INFO - PROCESS | 12223 | 13:27:20 INFO - PROCESS | 12223 | (process:12281): GLib-CRITICAL **: g_path_get_basename: assertion `file_name != NULL' failed 13:27:30 INFO - PROCESS | 12223 | RSS: Main: 150777856 13:27:30 INFO - PROCESS | 12223 | 13:27:33 INFO - PROCESS | 12223 | Cycle 1(1): loaded http://localhost:48718/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:48718/tests/kraken/driver.html?testName=audio-beat-detection) 13:27:33 INFO - PROCESS | 12223 | RSS: Main: 150278144 13:27:33 INFO - PROCESS | 12223 | 13:27:36 INFO - PROCESS | 12223 | Cycle 1(1): loaded http://localhost:48718/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:48718/tests/kraken/driver.html?testName=audio-dft) 13:27:37 INFO - PROCESS | 12223 | RSS: Main: 152784896 13:27:37 INFO - PROCESS | 12223 | 13:27:40 INFO - PROCESS | 12223 | Cycle 1(1): loaded http://localhost:48718/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:48718/tests/kraken/driver.html?testName=audio-fft) 13:27:40 INFO - PROCESS | 12223 | RSS: Main: 147664896 13:27:40 INFO - PROCESS | 12223 | 13:27:42 INFO - PROCESS | 12223 | Cycle 1(1): loaded http://localhost:48718/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:48718/tests/kraken/driver.html?testName=audio-oscillator) 13:27:43 INFO - PROCESS | 12223 | RSS: Main: 149999616 13:27:43 INFO - PROCESS | 12223 | 13:27:45 INFO - PROCESS | 12223 | Cycle 1(1): loaded http://localhost:48718/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:48718/tests/kraken/driver.html?testName=imaging-gaussian-blur) 13:27:46 INFO - PROCESS | 12223 | RSS: Main: 150659072 13:27:46 INFO - PROCESS | 12223 | 13:27:49 INFO - PROCESS | 12223 | Cycle 1(1): loaded http://localhost:48718/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:48718/tests/kraken/driver.html?testName=imaging-darkroom) 13:27:49 INFO - PROCESS | 12223 | RSS: Main: 149516288 13:27:49 INFO - PROCESS | 12223 | 13:27:53 INFO - PROCESS | 12223 | Cycle 1(1): loaded http://localhost:48718/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:48718/tests/kraken/driver.html?testName=imaging-desaturate) 13:27:53 INFO - PROCESS | 12223 | RSS: Main: 147447808 13:27:53 INFO - PROCESS | 12223 | 13:27:56 INFO - PROCESS | 12223 | Cycle 1(1): loaded http://localhost:48718/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:48718/tests/kraken/driver.html?testName=json-parse-financial) 13:27:57 INFO - PROCESS | 12223 | RSS: Main: 147501056 13:27:57 INFO - PROCESS | 12223 | 13:27:59 INFO - PROCESS | 12223 | Cycle 1(1): loaded http://localhost:48718/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:48718/tests/kraken/driver.html?testName=json-stringify-tinderbox) 13:27:59 INFO - PROCESS | 12223 | RSS: Main: 148836352 13:27:59 INFO - PROCESS | 12223 | 13:28:01 INFO - PROCESS | 12223 | Cycle 1(1): loaded http://localhost:48718/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:48718/tests/kraken/driver.html?testName=stanford-crypto-aes) 13:28:02 INFO - PROCESS | 12223 | RSS: Main: 147730432 13:28:02 INFO - PROCESS | 12223 | 13:28:04 INFO - PROCESS | 12223 | Cycle 1(1): loaded http://localhost:48718/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:48718/tests/kraken/driver.html?testName=stanford-crypto-ccm) 13:28:05 INFO - PROCESS | 12223 | RSS: Main: 147746816 13:28:05 INFO - PROCESS | 12223 | 13:28:07 INFO - PROCESS | 12223 | Cycle 1(1): loaded http://localhost:48718/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:48718/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 13:28:08 INFO - PROCESS | 12223 | RSS: Main: 147709952 13:28:08 INFO - PROCESS | 12223 | 13:28:10 INFO - PROCESS | 12223 | Cycle 1(1): loaded http://localhost:48718/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:48718/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 13:28:11 INFO - PROCESS | 12223 | RSS: Main: 148865024 13:28:11 INFO - PROCESS | 12223 | 13:28:13 INFO - PROCESS | 12223 | Cycle 1(1): loaded http://localhost:48718/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:48718/tests/kraken/driver.html?testName=ai-astar) 13:28:13 INFO - PROCESS | 12223 | RSS: Main: 148631552 13:28:13 INFO - PROCESS | 12223 | 13:28:13 INFO - PROCESS | 12223 | __start_tp_report 13:28:13 INFO - PROCESS | 12223 | _x_x_mozilla_page_load 13:28:13 INFO - PROCESS | 12223 | _x_x_mozilla_page_load_details 13:28:13 INFO - PROCESS | 12223 | |i|pagename|runs| 13:28:13 INFO - PROCESS | 12223 | |0;ai-astar;115;109;114;115;115;127;114;114;116;115 13:28:13 INFO - PROCESS | 12223 | |1;audio-beat-detection;155;132;155;172;138;160;155;133;185;142 13:28:13 INFO - PROCESS | 12223 | |2;audio-dft;162;162;164;162;164;163;174;160;168;164 13:28:13 INFO - PROCESS | 12223 | |3;audio-fft;75;72;73;75;144;75;73;73;77;150 13:28:13 INFO - PROCESS | 12223 | |4;audio-oscillator;97;97;141;97;99;98;136;98;98;129 13:28:13 INFO - PROCESS | 12223 | |5;imaging-gaussian-blur;111;110;110;110;111;110;110;110;110;110 13:28:13 INFO - PROCESS | 12223 | |6;imaging-darkroom;147;149;147;148;149;149;148;147;148;149 13:28:13 INFO - PROCESS | 12223 | |7;imaging-desaturate;100;96;96;96;96;97;96;96;96;97 13:28:13 INFO - PROCESS | 12223 | |8;json-parse-financial;71;72;73;73;73;73;74;78;70;72 13:28:13 INFO - PROCESS | 12223 | |9;json-stringify-tinderbox;67;68;67;67;66;68;67;67;69;68 13:28:13 INFO - PROCESS | 12223 | |10;stanford-crypto-aes;91;86;85;93;94;85;93;84;87;85 13:28:13 INFO - PROCESS | 12223 | |11;stanford-crypto-ccm;130;130;121;130;123;122;132;124;123;129 13:28:13 INFO - PROCESS | 12223 | |12;stanford-crypto-pbkdf2;138;148;150;151;150;136;148;147;151;140 13:28:13 INFO - PROCESS | 12223 | |13;stanford-crypto-sha256-iterative;71;72;72;74;73;70;71;72;78;71 13:28:13 INFO - PROCESS | 12223 | __end_tp_report 13:28:13 INFO - PROCESS | 12223 | __start_cc_report 13:28:13 INFO - PROCESS | 12223 | _x_x_mozilla_cycle_collect,784 13:28:13 INFO - PROCESS | 12223 | __end_cc_report 13:28:13 INFO - PROCESS | 12223 | __startTimestamp1452720493533__endTimestamp 13:28:13 INFO - PROCESS | 12223 | 13:28:13 INFO - PROCESS | 12223 | ------- Summary: start ------- 13:28:13 INFO - PROCESS | 12223 | Number of tests: 14 13:28:13 INFO - PROCESS | 12223 | 13:28:13 INFO - PROCESS | 12223 | [#0] ai-astar Cycles:10 Average:115.40 Median:115.00 stddev:4.50 (3.9%) stddev-sans-first:4.77 13:28:13 INFO - PROCESS | 12223 | Values: 115.0 109.0 114.0 115.0 115.0 127.0 114.0 114.0 116.0 115.0 13:28:13 INFO - PROCESS | 12223 | 13:28:13 INFO - PROCESS | 12223 | [#1] audio-beat-detection Cycles:10 Average:152.70 Median:155.00 stddev:17.10 (11.0%) stddev-sans-first:18.12 13:28:13 INFO - PROCESS | 12223 | Values: 155.0 132.0 155.0 172.0 138.0 160.0 155.0 133.0 185.0 142.0 13:28:13 INFO - PROCESS | 12223 | 13:28:13 INFO - PROCESS | 12223 | [#2] audio-dft Cycles:10 Average:164.30 Median:164.00 stddev:4.00 (2.4%) stddev-sans-first:4.16 13:28:13 INFO - PROCESS | 12223 | Values: 162.0 162.0 164.0 162.0 164.0 163.0 174.0 160.0 168.0 164.0 13:28:13 INFO - PROCESS | 12223 | 13:28:13 INFO - PROCESS | 12223 | [#3] audio-fft Cycles:10 Average:88.70 Median:74.00 stddev:30.79 (41.6%) stddev-sans-first:32.26 13:28:13 INFO - PROCESS | 12223 | Values: 75.0 72.0 73.0 75.0 144.0 75.0 73.0 73.0 77.0 150.0 13:28:13 INFO - PROCESS | 12223 | 13:28:13 INFO - PROCESS | 12223 | [#4] audio-oscillator Cycles:10 Average:109.00 Median:97.50 stddev:18.40 (18.9%) stddev-sans-first:19.00 13:28:13 INFO - PROCESS | 12223 | Values: 97.0 97.0 141.0 97.0 99.0 98.0 136.0 98.0 98.0 129.0 13:28:13 INFO - PROCESS | 12223 | 13:28:13 INFO - PROCESS | 12223 | [#5] imaging-gaussian-blur Cycles:10 Average:110.20 Median:110.00 stddev:0.42 (0.4%) stddev-sans-first:0.33 13:28:13 INFO - PROCESS | 12223 | Values: 111.0 110.0 110.0 110.0 111.0 110.0 110.0 110.0 110.0 110.0 13:28:13 INFO - PROCESS | 12223 | 13:28:13 INFO - PROCESS | 12223 | [#6] imaging-darkroom Cycles:10 Average:148.10 Median:148.50 stddev:0.88 (0.6%) stddev-sans-first:0.83 13:28:13 INFO - PROCESS | 12223 | Values: 147.0 149.0 147.0 148.0 149.0 149.0 148.0 147.0 148.0 149.0 13:28:13 INFO - PROCESS | 12223 | 13:28:13 INFO - PROCESS | 12223 | [#7] imaging-desaturate Cycles:10 Average:96.60 Median:96.00 stddev:1.26 (1.3%) stddev-sans-first:0.44 13:28:13 INFO - PROCESS | 12223 | Values: 100.0 96.0 96.0 96.0 96.0 97.0 96.0 96.0 96.0 97.0 13:28:13 INFO - PROCESS | 12223 | 13:28:13 INFO - PROCESS | 12223 | [#8] json-parse-financial Cycles:10 Average:72.90 Median:73.00 stddev:2.13 (2.9%) stddev-sans-first:2.15 13:28:13 INFO - PROCESS | 12223 | Values: 71.0 72.0 73.0 73.0 73.0 73.0 74.0 78.0 70.0 72.0 13:28:13 INFO - PROCESS | 12223 | 13:28:13 INFO - PROCESS | 12223 | [#9] json-stringify-tinderbox Cycles:10 Average:67.40 Median:67.50 stddev:0.84 (1.2%) stddev-sans-first:0.88 13:28:13 INFO - PROCESS | 12223 | Values: 67.0 68.0 67.0 67.0 66.0 68.0 67.0 67.0 69.0 68.0 13:28:13 INFO - PROCESS | 12223 | 13:28:13 INFO - PROCESS | 12223 | [#10] stanford-crypto-aes Cycles:10 Average:88.30 Median:89.00 stddev:3.97 (4.5%) stddev-sans-first:4.09 13:28:13 INFO - PROCESS | 12223 | Values: 91.0 86.0 85.0 93.0 94.0 85.0 93.0 84.0 87.0 85.0 13:28:13 INFO - PROCESS | 12223 | 13:28:13 INFO - PROCESS | 12223 | [#11] stanford-crypto-ccm Cycles:10 Average:126.40 Median:129.50 stddev:4.14 (3.2%) stddev-sans-first:4.18 13:28:13 INFO - PROCESS | 12223 | Values: 130.0 130.0 121.0 130.0 123.0 122.0 132.0 124.0 123.0 129.0 13:28:13 INFO - PROCESS | 12223 | 13:28:13 INFO - PROCESS | 12223 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:145.90 Median:149.00 stddev:5.69 (3.8%) stddev-sans-first:5.26 13:28:13 INFO - PROCESS | 12223 | Values: 138.0 148.0 150.0 151.0 150.0 136.0 148.0 147.0 151.0 140.0 13:28:13 INFO - PROCESS | 12223 | 13:28:13 INFO - PROCESS | 12223 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:72.40 Median:72.00 stddev:2.27 (3.2%) stddev-sans-first:2.35 13:28:13 INFO - PROCESS | 12223 | Values: 71.0 72.0 72.0 74.0 73.0 70.0 71.0 72.0 78.0 71.0 13:28:13 INFO - PROCESS | 12223 | -------- Summary: end -------- 13:28:13 INFO - PROCESS | 12223 | 13:28:14 INFO - TEST-INFO | 12223: exit 0 13:28:14 INFO - TEST-OK | kraken | took 61774ms 13:28:14 INFO - TEST-START | v8_7 13:28:14 INFO - operating with platform_type : linux_ 13:28:14 INFO - Initialising browser for v8_7 test... 13:28:14 INFO - TEST-INFO | started process 12509 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpFpaSDw/profile http://localhost:48718/getInfo.html) 13:28:18 INFO - PROCESS | 12509 | 13:28:18 INFO - PROCESS | 12509 | (process:12578): GLib-CRITICAL **: g_path_get_basename: assertion `file_name != NULL' failed 13:28:19 INFO - PROCESS | 12509 | __metrics Screen width/height:1600/1200 13:28:19 INFO - PROCESS | 12509 | colorDepth:24 13:28:19 INFO - PROCESS | 12509 | Browser inner width/height: 1024/697 13:28:19 INFO - PROCESS | 12509 | __metrics 13:28:19 INFO - PROCESS | 12509 | JavaScript error: resource://gre/modules/PerformanceStats.jsm, line 211: NS_ERROR_NOT_AVAILABLE: Component returned failure code: 0x80040111 (NS_ERROR_NOT_AVAILABLE) [nsIPerformanceStatsService.isMonitoringJank] 13:28:20 INFO - TEST-INFO | 12509: exit 0 13:28:20 INFO - Browser initialized. 13:28:20 INFO - Running cycle 1/1 for v8_7 test... 13:28:20 INFO - TEST-INFO | started process 12627 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpFpaSDw/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/v8_7/v8.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 13:28:21 INFO - PROCESS | 12627 | 13:28:21 INFO - PROCESS | 12627 | (process:12685): GLib-CRITICAL **: g_path_get_basename: assertion `file_name != NULL' failed 13:28:32 INFO - PROCESS | 12627 | RSS: Main: 150474752 13:28:32 INFO - PROCESS | 12627 | 13:28:54 INFO - PROCESS | 12627 | Cycle 1(1): loaded http://localhost:48718/tests/v8_7/run.html (next: http://localhost:48718/tests/v8_7/run.html) 13:28:55 INFO - PROCESS | 12627 | RSS: Main: 144183296 13:28:55 INFO - PROCESS | 12627 | 13:28:55 INFO - PROCESS | 12627 | __start_tp_report 13:28:55 INFO - PROCESS | 12627 | _x_x_mozilla_page_load 13:28:55 INFO - PROCESS | 12627 | _x_x_mozilla_page_load_details 13:28:55 INFO - PROCESS | 12627 | |i|pagename|runs| 13:28:55 INFO - PROCESS | 12627 | |0;Richards;167.7008217340265 13:28:55 INFO - PROCESS | 12627 | |1;DeltaBlue;187.5468867216804 13:28:55 INFO - PROCESS | 12627 | |2;Encrypt;277.700638711469 13:28:55 INFO - PROCESS | 12627 | |3;Decrypt;5181.347150259067 13:28:55 INFO - PROCESS | 12627 | |4;RayTrace;1116.0714285714287 13:28:55 INFO - PROCESS | 12627 | |5;Earley;707.2135785007072 13:28:55 INFO - PROCESS | 12627 | |6;Boyer;12317.073170731708 13:28:55 INFO - PROCESS | 12627 | |7;RegExp;43166.666666666664 13:28:55 INFO - PROCESS | 12627 | |8;Splay;593.1198102016607 13:28:55 INFO - PROCESS | 12627 | |9;NavierStokes;4826.923076923077 13:28:55 INFO - PROCESS | 12627 | __end_tp_report 13:28:55 INFO - PROCESS | 12627 | __startTimestamp1452720535059__endTimestamp 13:28:55 INFO - PROCESS | 12627 | 13:28:55 INFO - PROCESS | 12627 | ------- Summary: start ------- 13:28:55 INFO - PROCESS | 12627 | Number of tests: 10 13:28:55 INFO - PROCESS | 12627 | 13:28:55 INFO - PROCESS | 12627 | [#0] Richards Cycles:1 Average:167.70 Median:167.70 stddev:0.00 (0.0%) 13:28:55 INFO - PROCESS | 12627 | Values: 167.7 13:28:55 INFO - PROCESS | 12627 | 13:28:55 INFO - PROCESS | 12627 | [#1] DeltaBlue Cycles:1 Average:187.55 Median:187.55 stddev:0.00 (0.0%) 13:28:55 INFO - PROCESS | 12627 | Values: 187.5 13:28:55 INFO - PROCESS | 12627 | 13:28:55 INFO - PROCESS | 12627 | [#2] Encrypt Cycles:1 Average:277.70 Median:277.70 stddev:0.00 (0.0%) 13:28:55 INFO - PROCESS | 12627 | Values: 277.7 13:28:55 INFO - PROCESS | 12627 | 13:28:55 INFO - PROCESS | 12627 | [#3] Decrypt Cycles:1 Average:5181.35 Median:5181.35 stddev:0.00 (0.0%) 13:28:55 INFO - PROCESS | 12627 | Values: 5181.3 13:28:55 INFO - PROCESS | 12627 | 13:28:55 INFO - PROCESS | 12627 | [#4] RayTrace Cycles:1 Average:1116.07 Median:1116.07 stddev:0.00 (0.0%) 13:28:55 INFO - PROCESS | 12627 | Values: 1116.1 13:28:55 INFO - PROCESS | 12627 | 13:28:55 INFO - PROCESS | 12627 | [#5] Earley Cycles:1 Average:707.21 Median:707.21 stddev:0.00 (0.0%) 13:28:55 INFO - PROCESS | 12627 | Values: 707.2 13:28:55 INFO - PROCESS | 12627 | 13:28:55 INFO - PROCESS | 12627 | [#6] Boyer Cycles:1 Average:12317.07 Median:12317.07 stddev:0.00 (0.0%) 13:28:55 INFO - PROCESS | 12627 | Values: 12317.1 13:28:55 INFO - PROCESS | 12627 | 13:28:55 INFO - PROCESS | 12627 | [#7] RegExp Cycles:1 Average:43166.67 Median:43166.67 stddev:0.00 (0.0%) 13:28:55 INFO - PROCESS | 12627 | Values: 43166.7 13:28:55 INFO - PROCESS | 12627 | 13:28:55 INFO - PROCESS | 12627 | [#8] Splay Cycles:1 Average:593.12 Median:593.12 stddev:0.00 (0.0%) 13:28:55 INFO - PROCESS | 12627 | Values: 593.1 13:28:55 INFO - PROCESS | 12627 | 13:28:55 INFO - PROCESS | 12627 | [#9] NavierStokes Cycles:1 Average:4826.92 Median:4826.92 stddev:0.00 (0.0%) 13:28:55 INFO - PROCESS | 12627 | Values: 4826.9 13:28:55 INFO - PROCESS | 12627 | -------- Summary: end -------- 13:28:55 INFO - PROCESS | 12627 | 13:28:56 INFO - TEST-INFO | 12627: exit 0 13:28:56 INFO - TEST-OK | v8_7 | took 41449ms 13:28:56 INFO - SUITE-END | took 1217s 13:28:56 INFO - Completed test suite (00:20:17) 13:28:56 INFO - Working with test: dromaeo_css 13:28:56 INFO - Generating results file: dromaeo_css 13:28:56 INFO - Working with test: kraken 13:28:56 INFO - Generating results file: kraken 13:28:56 INFO - javascript benchmark 13:28:56 INFO - Working with test: v8_7 13:28:56 INFO - Generating results file: v8_7 13:28:56 INFO - Posting result 0 of 3 to http://graphs.mozilla.org/server/collect.cgi, attempt 0 13:28:56 INFO - process_Request line: dromaeo_css graph.html#tests=[[72,132,43]] 13:28:56 INFO - process_Request line: dromaeo_css 6049.78 graph.html#tests=[[72,132,43]] 13:28:56 INFO - Posting result 1 of 3 to http://graphs.mozilla.org/server/collect.cgi, attempt 0 13:28:56 INFO - process_Request line: kraken 1558.30 graph.html#tests=[[232,132,43]] 13:28:56 INFO - Posting result 2 of 3 to http://graphs.mozilla.org/server/collect.cgi, attempt 0 13:28:56 INFO - process_Request line: v8_7 20260.00 graph.html#tests=[[230,132,43]] 13:28:56 INFO - RETURN: dromaeo_css: 6049.78 13:28:56 INFO - RETURN: kraken: 1558.30 13:28:56 INFO - RETURN: v8_7: 20260.00 13:28:56 INFO - javascript benchmark 13:28:56 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"lowerIsBetter": false, "subtests": [{"lowerIsBetter": false, "replicates": [2621.7902567794554, 2630.539655560277, 2660.2152365052307, 2685.9999999999986, 2703.1214855172066, 4367.366731823884, 4522.773861306934, 4555.886102847422, 4556.384888040114, 4579.0, 4483.327500874871, 4493.752843593601, 4533.0, 4569.794359253833, 4570.885727856805, 4207.831686732535, 4217.198732240864, 4274.252005898971, 4281.015366465715, 4330.805113769888, 4221.0291632924445, 4227.894302642428, 4267.530571637118, 4279.1441711657635, 4295.849645262417, 4110.157417729359, 4138.420621113017, 4176.519700234481, 4182.20538097762, 4193.329067349209, 4179.0, 4200.1179752252065, 4205.411242426063, 4210.221109094828, 4229.048464095585, 4169.854055108057, 4175.3945677876845, 4187.413762073312, 4216.494020717533, 4226.598473145046, 4310.137972405531, 4379.64962802975, 4455.153520831064, 4496.392986946753, 4598.425196850394, 4730.219513780222, 4748.715077095385, 4752.5247475252545, 4755.334253204554, 4775.5463230993, 4788.856334309976, 4797.472278049412, 4802.5197480252045, 4814.614830813526, 4852.369192005052, 4399.538048504893, 4480.910381792379, 4490.932636010462, 4516.638668906479, 4569.840055598104, 4895.951040489549, 4916.557509824133, 4919.557239848431, 4959.082569724613, 4971.477994810492, 4604.0, 4743.31221972812, 4743.430788305425, 4751.477337492873, 4802.063597598435, 4743.905121897543, 4790.904181916342, 4796.856094317176, 4840.878978025577, 4884.316195732529, 4776.641751868624, 4786.329913812069, 4792.616590672737, 4793.9280910786365, 4837.250226214942, 4627.3521706961055, 4702.88242793926, 4743.833965811249, 4783.1390349737385, 4800.5199480052415, 4011.29802284599, 4041.2321658885307, 4050.270951228807, 4078.938815917764, 4093.4473846031, 3533.5936367318086, 3538.0447279234463, 3559.964400356015, 3577.606463289036, 3585.4263317869018, 4069.1658210066867, 4149.3775933609595, 4192.769397683096, 4203.432536607519, 4208.705390622627, 4885.047415753965, 4886.731229782325, 4891.388576427947, 4912.95087049125, 4921.311016457699, 4174.812133454002, 4213.367994800805, 4216.987922898482, 4222.831086756557, 4253.149370125987, 4190.601892820177, 4245.830166793294, 4303.548127446636, 4308.353746937984, 4404.053128577371, 4501.3022981437925, 4514.052049069732, 4526.977365113154, 4530.524294949048, 4566.474855391606, 4816.060868130681, 4820.71075735457, 4820.9517904821905, 4823.975880120577, 4855.2717092435005, 4457.621102206349, 4525.411696479437, 4603.033362993809, 4627.444706635225, 4665.973485833111, 4745.217039188496, 4746.596539294061, 4757.476677565396, 4758.072175925661, 4777.761111944319, 4771.928421073617, 4832.492588278321, 4834.444038935568, 4859.95140048595, 4872.025594881109, 4683.531646835289, 4757.762111894461, 4788.11419887322, 4792.640551958547, 4816.590589799906, 4735.313379560013, 4753.952460475351, 4775.379200703886, 4791.880202994814, 4808.903821923612, 4496.527864574173, 4603.171429142786, 4690.530946905282, 4693.061387722538, 4738.7867545959825, 4661.30080487916, 4794.2808578713475, 4801.423829140525, 4837.733924634179, 4849.369581954324, 4655.0, 4665.113628410591, 4670.9766451167525, 4673.532646735299, 4680.672352935262], "unit": "score", "name": "dojo.html", "value": 4447.51162449739}, {"lowerIsBetter": false, "replicates": [499.340870051532, 502.7913415932388, 529.4546616984506, 530.8221745715185, 544.6242092955857, 33373.83313083434, 34656.30687386251, 34661.13347166322, 34679.30641387171, 34704.826475867616, 35877.0, 36144.2771144577, 36329.27341453176, 36394.27211455776, 36435.63564364355, 7329.926700732991, 7494.850102997937, 7504.212057733941, 7519.887201691951, 7531.2468753124795, 7644.312011918926, 7732.690692372326, 7774.766756997299, 7776.533407995538, 7828.608569571527, 7704.576248306341, 7757.728479503218, 7801.063872335328, 7823.687052517893, 7825.569593672346, 7727.497712648688, 7769.145394006655, 7778.49439786412, 7821.648025838851, 7831.334336581341, 7582.772516824504, 7729.304362607336, 7731.304182623591, 7737.57443340616, 7771.106322772897, 33249.168770780685, 33615.6638433615, 33700.0, 33733.493997590056, 33881.83059084714, 2873.540233562641, 2948.7051294870344, 2952.8228306301476, 2973.6580293266334, 3136.764742644288, 27279.0, 27676.584851227246, 27775.305617359525, 27951.161465156078, 28525.714742852513, 3367.6632336766374, 3386.1365351835125, 3386.6613338666184, 3462.5325581046486, 3545.2377738786286, 162297.18851405787, 163902.1804890968, 164050.0, 164275.0, 165153.0, 46533.53466465292, 47330.76334618374, 50366.244506332434, 55179.0, 56315.0, 48309.75845120752, 48509.75745121252, 48538.27192592114, 48726.51273487291, 48746.75626621844, 12761.808572871414, 12770.80843787344, 12850.164739291917, 12872.22766634005, 13037.804432933513, 10230.590776368861, 10231.744206394751, 10235.078842904026, 10245.129164021142, 10266.0, 18222.544436388933, 18343.35798247055, 18402.35591754282, 18449.631007379776, 18488.72266915997, 7594.468387212842, 7745.573993430416, 7868.370530357558, 7927.207279272026, 7944.84110317802, 746.305935479998, 802.7110240313483, 843.4348986179275, 857.7984173719171, 891.80826122384, 23145.421364466023, 23453.530929381315, 24548.140815071387, 24703.50592988166, 24792.876035619705, 967.874176357069, 968.1190116993503, 978.5351957819978, 993.7416271769392, 1017.8269694152012, 12156.5137394505, 12174.57388991381, 12260.386980650932, 12271.0, 12309.446074926649, 305087.0, 309011.0, 309517.0, 310022.0, 310159.0, 46869.0, 47448.28827567589, 47471.76264118657, 47518.0, 47520.5247947523, 1193.242291145129, 1212.2120621595857, 1225.993870030662, 1231.5258625429274, 1233.969150771238, 24210.273691789276, 25020.62469062929, 25131.87434062818, 25210.243692689248, 25371.238862834143, 35240.47139292964, 35413.82293088518, 35725.0, 35739.0, 35800.28399432049, 239458.0, 241735.0, 242388.0, 242391.0, 242621.0, 28367.723452444276, 37837.24325513419, 38152.0, 38523.0, 38664.6133538661, 33450.163745906546, 33905.32189356248, 34244.65755342415, 34261.72568030166, 34366.14084647904, 30148.547771783004, 31136.688633114285, 31962.52056219112, 32427.513587296682, 32520.674793251765, 31508.0, 31956.840215798773, 32083.35833283368, 32710.182245444055, 34246.48630270498, 31829.522557162123, 31975.0, 32650.183745406553, 32781.18047048843, 32781.672183277864, 28727.712722872504, 28739.28151796222, 30131.698683012888, 30220.84889575538, 30563.0, 23908.0, 24154.275371738877, 24500.632490513013, 24835.0, 24883.377915552257], "unit": "score", "name": "ext.html", "value": 16214.027098356137}, {"lowerIsBetter": false, "replicates": [341.60203363081996, 343.63231342463564, 347.260335485416, 348.0637086238018, 348.16440542697524, 13768.793468097974, 13842.0, 14971.625709357271, 15613.609659758484, 16103.999999999985, 10334.793304133913, 10578.78842423151, 12980.0, 15258.313375898084, 15333.463328783495, 4428.914915845614, 4519.2995085761595, 4604.056168485469, 4925.310456536088, 4930.112579735646, 4849.224124140138, 4918.458969513351, 4958.950410495903, 4978.5270399312185, 5000.374953130859, 4517.616002639779, 4891.926621100669, 4953.182724850395, 5078.669886457368, 5083.872903177413, 4885.218365061609, 4947.257911313296, 4991.126552853254, 5022.447530771612, 5198.610104242159, 5036.320096786923, 5056.84829455117, 5071.366079240095, 5074.720890351029, 5076.086304465195, 10605.098566621846, 15920.52238432849, 17619.471415857544, 18242.63514729711, 18271.44692701122, 1759.0852756566642, 1804.7022241330164, 1812.8368446839715, 1823.8358547730768, 1827.8263564961308, 8981.191692747683, 11281.887181128248, 11974.22167559106, 12219.511219551207, 12221.511139554406, 1677.211710496077, 1746.1792957310172, 1760.6390689908537, 1765.4438851761781, 1786.214065811039, 48627.513724863005, 49925.500744992445, 50245.497545024446, 50671.23993140106, 50855.74572127152, 9326.487043212688, 9548.092931171528, 9555.140037396528, 9641.084097010773, 9643.517824108767, 12120.212186207867, 12138.150329476852, 12143.757124857453, 12148.635540933787, 12167.878321216851, 6878.8624227515165, 6990.300969903071, 7061.858762824818, 7097.432205423554, 7106.5736055836815, 6668.466522678174, 6687.799366019027, 6729.831754206086, 6751.594904305757, 6757.121574195323, 3968.0476685595827, 4062.5531191568903, 4113.197926404382, 4115.73247738896, 4142.357934520154, 1642.1789105447276, 1772.0962309222389, 1786.9992804029785, 1797.2631221199244, 1798.8740788144967, 811.5130921447085, 908.6365453818394, 912.3248795890993, 915.1489115122866, 976.6728146071146, 11844.348560829065, 13886.513972010931, 13950.977108319237, 13993.30033498321, 14437.494687685881, 807.2936180841764, 861.1388611388611, 863.1541089732098, 875.5797217335714, 899.3839220134229, 8234.547099909443, 8299.170082991652, 8457.281131103802, 8622.26710729595, 8731.650733970697, 386219.0, 388037.0, 416351.0, 434097.0, 439293.0, 37866.62133378686, 58938.0, 58961.0, 59813.70093149506, 60255.397446025854, 1049.7847941172042, 1051.9789604207872, 1061.7823346214007, 1068.2949253492657, 1083.4799296337644, 13221.735565288833, 13230.206187628773, 13290.0, 13304.667383315495, 13478.32608369558, 28321.858390707916, 28342.433151336445, 28384.858075710315, 28658.570121447778, 28711.282217944718, 34998.82500587481, 35448.645513544536, 36232.456513151796, 36390.63609363978, 37528.0, 6343.0, 6352.491800655844, 6590.8352291193105, 6621.370969757865, 6730.528862979741, 8533.658653653783, 9668.516574171404, 9681.612735490784, 9898.10917017472, 10522.31604945676, 8043.517388956681, 8594.183552562497, 8594.226519613265, 8709.433886797338, 8824.0, 8627.568621569022, 8901.910980890108, 9029.36794424384, 9418.905810941802, 9500.144986951207, 8840.602172902107, 8954.552272386485, 9187.127222913812, 9267.073292670948, 9297.86053209216, 6597.373249541286, 6607.9669601651685, 6851.931480685129, 6876.69054892541, 6883.105196324445, 7742.65158067877, 8082.7171049013, 8310.958445207736, 8362.958185209034, 8374.413791034569], "unit": "score", "name": "jquery.html", "value": 7358.67872894829}, {"lowerIsBetter": false, "replicates": [1385.4735200623766, 1410.8377536583293, 1520.3386526860816, 1693.8136804951446, 1712.1011468978793, 5930.258717660293, 6058.7879424220055, 6508.414242718154, 6647.933520664798, 6689.163854518185, 6445.742170313182, 6553.082568440422, 6611.173603299588, 6654.966725166368, 6659.667016649172, 2053.6303465376227, 2086.1968142265187, 2089.759677637076, 2090.4878304815265, 2093.005822234442, 1958.7845337012918, 1976.6244413561449, 1986.682130859063, 1989.6020795840818, 1994.3618042226494, 2015.6472617291988, 2048.5595596946655, 2056.9485762855898, 2064.194963964055, 2091.435312465633, 2088.853780235384, 2090.2788537954457, 2092.7593326767465, 2094.413564202026, 2096.75887272964, 2004.9599008019904, 2018.7981201879695, 2049.5388537578924, 2056.0953180600486, 2057.0537552725764, 6932.029515867783, 6945.548539344926, 6952.721891124349, 6960.512764106515, 6995.8950615740805, 3952.130531283113, 4031.516218053823, 4035.3341698619693, 4039.252738243405, 4043.4945631796027, 2566.8459892406518, 2584.754448327406, 2585.263199988013, 2747.409306999005, 2747.587861820723, 813.829095889858, 834.2283387866261, 838.1325328285257, 841.6197436204629, 1752.6056637256643, 8752.037275899645, 8771.956140219258, 8818.030016698158, 8840.646374145026, 8875.112488751138, 3463.8268086595567, 3511.1573222426946, 3540.0, 3553.697935675445, 3590.120420496995, 7284.745033923788, 7346.1551921528635, 7347.08161479815, 7380.852382952311, 7389.926100739031, 3956.1098752780968, 3967.107400834789, 3971.285168669667, 3995.220931918306, 3999.200159968018, 3284.5894263217097, 3359.613644430922, 3705.09225239818, 3714.888553343404, 3747.0819649186124, 3108.129723677374, 3128.5307203919137, 3144.701253380925, 3145.6067991501063, 3167.524871269282, 918.2195134135931, 936.8782058332373, 937.1799675284126, 940.1632547033146, 957.9089986451276, 970.8301047316692, 982.474376208725, 1001.689476262361, 1005.6982905128432, 1007.3552926127285, 6335.936640633535, 6364.64994425311, 6397.168368112209, 6398.424141827258, 6405.48756099511, 401.1075357329918, 406.4918851435705, 411.1284077755178, 412.8039181388816, 413.51825123730515, 5135.6148288878485, 5235.633505654644, 5244.423113457517, 5259.868503287372, 5283.181106928432, 7574.242575742492, 7643.69425222996, 7847.9607601961625, 7861.056673199253, 7882.172371900868, 7763.689452421952, 7780.4553681242905, 7828.099768526692, 7846.568438735811, 7849.215078492105, 6064.9090263646085, 6205.472534834499, 6217.751289948352, 6223.253209614875, 6245.906311405332, 6361.586496877688, 6405.711742971671, 6427.292997770148, 6445.12990746262, 6450.516211284079, 7053.506254562337, 7155.069840920647, 7403.851922961619, 7423.406127509894, 7472.364848987897, 7422.183559808309, 7555.773326800205, 7572.7728168155045, 7625.733099341496, 7714.421418393756, 5262.105442074933, 5407.594430417813, 5911.3201981772645, 6083.604565703392, 6087.756489740361, 6020.9764340063175, 6066.423689749467, 6066.878662426815, 6067.939320606737, 6075.36208698098, 5813.593048486566, 5921.940780592311, 5925.200097986889, 6007.609505382311, 6110.572259941761, 5622.85942851432, 5736.0, 5817.0983497557945, 5924.140999555127, 5927.377625349276, 5900.734466949083, 6066.0, 6100.176476175837, 6172.783952561639, 6204.224471941007, 5595.63628364155, 5637.774489020393, 5685.545156387397, 5701.486866182064, 5704.258446401941, 5718.771249149988, 5730.054541000688, 5731.656100633975, 5733.2260144881575, 5745.770169193185], "unit": "score", "name": "mootools.html", "value": 3797.4024577051455}, {"lowerIsBetter": false, "replicates": [296.2445763303576, 305.57067320414825, 308.1018830110229, 309.32875659818177, 312.46412402729317, 5499.807506737265, 5564.360098588659, 5574.916376254359, 5657.292838395206, 5739.426057394258, 5547.805826796063, 5599.076152434844, 5615.522680572146, 5618.381977982429, 5619.381867994517, 4048.67610591152, 4141.378793181017, 4244.511881133678, 4287.699861009731, 4290.442242508478, 4149.564295748948, 4252.170826688797, 4252.255855225339, 4258.276093064171, 4281.914361712764, 4247.766372849492, 4257.425247591582, 4258.680598955075, 4260.02019535507, 4263.2965560682605, 4241.681873859473, 4253.617174454314, 4261.914761704748, 4264.147170565884, 4267.594578515036, 3679.6504332088407, 3682.760620559655, 3692.7415080944343, 3694.1688120173017, 3703.129764505339, 5175.0, 5247.711375874325, 5337.092694241988, 5364.839054828361, 5365.141577347606, 4872.634552408548, 4892.192788189945, 4893.314935908976, 4896.412430508326, 4898.681585696918, 5851.093080572518, 5874.412558744134, 5895.528357731371, 5921.023031199847, 5937.881242375129, 3807.124361396894, 4014.698897582664, 4015.6185162409524, 4017.4978127734034, 4023.2154729827694, 6007.128966299906, 6211.378862113753, 6221.408966148254, 6233.065040243954, 6236.033414820756, 4069.206504731608, 4087.795610219477, 4112.239235741397, 4122.319817230184, 4131.173765246903, 4144.834206631701, 4172.144710334374, 4178.143480586473, 4178.22702799983, 4197.0, 4749.525047495292, 4851.975740121347, 4852.053849499384, 4852.830150944771, 4855.441624213261, 5864.765409383577, 5874.913141068831, 5888.087346461305, 5911.615744976562, 5919.822405327847, 1448.1021766504623, 1486.5466032860081, 1486.6580686442178, 1487.5760408283588, 1487.8660920517204, 972.9270304727174, 974.8196583632051, 975.0298453039271, 980.7352014955922, 983.5475681186734, 5115.514026167582, 5119.283300337956, 5128.512791284822, 5128.8461346159675, 5129.512696293846, 6123.540734444845, 6138.324784273726, 6146.846328841814, 6146.969265153645, 6149.108379284979, 5102.285680004802, 5108.182690769459, 5117.130087885069, 5131.153359695609, 5132.948670513247, 3269.800679928216, 3284.7372210223125, 3316.2372654289647, 3346.8828590999196, 3348.2131699050706, 5609.186667933127, 5739.16782066598, 5746.109353050284, 5753.741081651336, 5753.971230143822, 6359.618422894641, 6360.141380913517, 6379.043143528508, 6394.552381333262, 6403.967980160162, 5767.0, 5779.595428319977, 5785.971070144622, 5793.652380857162, 5795.971020144957, 6168.414000669929, 6186.257649082139, 6206.565540412128, 6211.223597050369, 6220.471259942956, 5822.970885145547, 6042.728077236623, 6077.787277445268, 6078.240219972504, 6084.361142080018, 5784.1034639630925, 5784.4504772046585, 5794.82615521535, 5802.100674395476, 5807.564432667651, 4029.6373326400767, 4121.216968776042, 4126.855560055384, 4127.463429754112, 4136.276151673505, 6067.150598916067, 6188.9690551546955, 6193.327801493661, 6200.286966998853, 6202.782902598387, 5961.761529538943, 5969.8806023878415, 5973.940260597512, 5978.312494063064, 5981.252343457068, 5915.201447804491, 5948.672822994777, 5964.850878727893, 6029.547783916311, 6051.425114614105, 5732.398098199629, 5754.108113242454, 5798.275215598051, 5819.243498345188, 5849.181114644039, 5956.731947062306, 5978.252718410199, 5984.072468767348, 5987.221661184192, 5991.101334799815, 5762.7694892203845, 5774.48029677331, 5811.953848307346, 5814.738336774771, 5823.941760582509], "unit": "score", "name": "prototype.html", "value": 4390.373511944703}, {"lowerIsBetter": false, "replicates": [726.7093162734906, 733.5452019747758, 769.3883362726632, 779.582923136122, 781.4646966827723, 10851.782964340708, 10973.945130274358, 10976.396298203596, 10983.0, 10986.0, 11193.328400295988, 11218.831717524243, 11222.887771122307, 11234.831477527823, 11267.323960562371, 768.8731359325704, 775.751759436979, 791.4143533785016, 805.6898094233703, 805.7784109369911, 781.269513005339, 785.6857257097149, 790.3835008693228, 791.1692722641233, 793.6111305460312, 826.6362800367818, 829.0341751859077, 829.7261903571837, 830.0578843013193, 832.5254604875223, 819.5041999590252, 819.635262308273, 819.6516480495766, 821.8685010398367, 823.9464434811719, 598.3059650805045, 600.7236671131285, 603.1013789453726, 607.5504126946072, 612.0574315554042, 12293.508259669692, 12368.319742414164, 12400.689982750504, 12439.191452555646, 12448.190867593577, 11418.600348987746, 11495.655130346104, 11744.823827642593, 11751.06875182671, 11886.40567971598, 9587.616495340179, 9648.083432073941, 9781.51092445382, 9860.112589866874, 9863.60545578176, 3181.1812408693736, 3190.441672707267, 3205.102571280045, 3236.7086962173516, 3277.7869438486423, 40851.0, 41019.0, 41517.1696566067, 41610.0, 41631.58368416307, 9332.486713230837, 9350.345475816763, 9421.152096311365, 9512.334136610509, 9531.523423828781, 15779.763303550455, 15831.0, 15887.443939462064, 15966.76049859253, 15975.840241597667, 6415.390537898892, 6529.902051469232, 6534.150560427209, 6534.575252608565, 6780.796576102724, 3502.5446691929887, 3599.028262369198, 3706.5737440194184, 3717.3617126593244, 3784.413415920537, 2451.105346548497, 2592.2223333000024, 2622.462395208978, 2626.7898568114506, 2627.1724406811795, 484.10264566569055, 485.1437213318496, 485.94411642661544, 489.0902920567741, 489.7600175913777, 426.73968878983794, 441.35782436555377, 494.78971437139074, 502.4121777520237, 531.2031952071892, 6352.460040896575, 6726.966365168143, 6805.795826125224, 6847.657617119125, 6881.759138430231, 544.7330807904099, 545.6671430427436, 550.7741825851382, 553.5986409852904, 562.2830890614417, 3317.270200555874, 3404.438267685804, 3409.301093275922, 3804.961950380516, 3814.3324918139215, 39485.80257098754, 40017.79991100084, 40101.799491002945, 40195.598044019185, 40239.0, 40406.19187616231, 40888.38667419991, 41651.16697666029, 41939.0, 42630.57369426328, 35176.82411587977, 35247.118822029144, 37946.24107517834, 39469.0, 39587.0, 8255.669773209245, 8379.413441059067, 8387.580620969049, 8419.494830310201, 8506.021807492218, 29211.415771684024, 29437.85281073581, 30221.244468888453, 30424.239394015327, 30473.0, 32195.678043219268, 33346.33307333888, 33571.160720982174, 33589.49615755815, 37936.43095353627, 9445.48049857237, 9708.320417570701, 9929.205483829188, 10078.496075196064, 10116.494175291353, 11200.83198752003, 11352.829707554558, 11496.195266331277, 11517.021053210236, 11681.532738690357, 9897.950510247403, 9994.400335979864, 10390.636327728493, 10656.0, 10799.784004320027, 9974.850377244493, 10019.398836069859, 10078.748031298983, 10092.394456332644, 10358.119559837498, 8935.955320223356, 9550.18823399991, 9608.75978100553, 9716.174125199437, 10598.364098154136, 8403.915960840557, 8458.830823383621, 8465.36509761758, 8509.038007630088, 8763.561821909007, 8438.789030274293, 8790.0, 8805.16350946659, 8863.778405539913, 8957.372983891066], "unit": "score", "name": "yui.html", "value": 5541.149523967222}], "name": "dromaeo_css", "value": 6049.786231516139}, {"lowerIsBetter": true, "subtests": [{"lowerIsBetter": true, "replicates": [115.0, 109.0, 114.0, 115.0, 115.0, 127.0, 114.0, 114.0, 116.0, 115.0], "unit": "score", "name": "ai-astar", "value": 115.4}, {"lowerIsBetter": true, "replicates": [155.0, 132.0, 155.0, 172.0, 138.0, 160.0, 155.0, 133.0, 185.0, 142.0], "unit": "score", "name": "audio-beat-detection", "value": 152.7}, {"lowerIsBetter": true, "replicates": [162.0, 162.0, 164.0, 162.0, 164.0, 163.0, 174.0, 160.0, 168.0, 164.0], "unit": "score", "name": "audio-dft", "value": 164.3}, {"lowerIsBetter": true, "replicates": [75.0, 72.0, 73.0, 75.0, 144.0, 75.0, 73.0, 73.0, 77.0, 150.0], "unit": "score", "name": "audio-fft", "value": 88.7}, {"lowerIsBetter": true, "replicates": [97.0, 97.0, 141.0, 97.0, 99.0, 98.0, 136.0, 98.0, 98.0, 129.0], "unit": "score", "name": "audio-oscillator", "value": 109.0}, {"lowerIsBetter": true, "replicates": [111.0, 110.0, 110.0, 110.0, 111.0, 110.0, 110.0, 110.0, 110.0, 110.0], "unit": "score", "name": "imaging-gaussian-blur", "value": 110.2}, {"lowerIsBetter": true, "replicates": [147.0, 149.0, 147.0, 148.0, 149.0, 149.0, 148.0, 147.0, 148.0, 149.0], "unit": "score", "name": "imaging-darkroom", "value": 148.1}, {"lowerIsBetter": true, "replicates": [100.0, 96.0, 96.0, 96.0, 96.0, 97.0, 96.0, 96.0, 96.0, 97.0], "unit": "score", "name": "imaging-desaturate", "value": 96.6}, {"lowerIsBetter": true, "replicates": [71.0, 72.0, 73.0, 73.0, 73.0, 73.0, 74.0, 78.0, 70.0, 72.0], "unit": "score", "name": "json-parse-financial", "value": 72.9}, {"lowerIsBetter": true, "replicates": [67.0, 68.0, 67.0, 67.0, 66.0, 68.0, 67.0, 67.0, 69.0, 68.0], "unit": "score", "name": "json-stringify-tinderbox", "value": 67.4}, {"lowerIsBetter": true, "replicates": [91.0, 86.0, 85.0, 93.0, 94.0, 85.0, 93.0, 84.0, 87.0, 85.0], "unit": "score", "name": "stanford-crypto-aes", "value": 88.3}, {"lowerIsBetter": true, "replicates": [130.0, 130.0, 121.0, 130.0, 123.0, 122.0, 132.0, 124.0, 123.0, 129.0], "unit": "score", "name": "stanford-crypto-ccm", "value": 126.4}, {"lowerIsBetter": true, "replicates": [138.0, 148.0, 150.0, 151.0, 150.0, 136.0, 148.0, 147.0, 151.0, 140.0], "unit": "score", "name": "stanford-crypto-pbkdf2", "value": 145.9}, {"lowerIsBetter": true, "replicates": [71.0, 72.0, 72.0, 74.0, 73.0, 70.0, 71.0, 72.0, 78.0, 71.0], "unit": "score", "name": "stanford-crypto-sha256-iterative", "value": 72.4}], "name": "kraken", "value": 1558.3000000000004}, {"lowerIsBetter": false, "subtests": [{"lowerIsBetter": false, "replicates": [167.7008217340265], "unit": "score", "name": "Richards", "value": 210.50582599999998}, {"lowerIsBetter": false, "replicates": [187.5468867216804], "unit": "score", "name": "DeltaBlue", "value": 352.54117599999995}, {"lowerIsBetter": false, "replicates": [277.700638711469], "unit": "score", "name": "Encrypt", "value": 958.5177809999998}, {"lowerIsBetter": false, "replicates": [5181.347150259067], "unit": "score", "name": "Decrypt", "value": 51.372933}, {"lowerIsBetter": false, "replicates": [1116.0714285714287], "unit": "score", "name": "RayTrace", "value": 663.0301440000001}, {"lowerIsBetter": false, "replicates": [707.2135785007072], "unit": "score", "name": "Earley", "value": 942.3786820000003}, {"lowerIsBetter": false, "replicates": [12317.073170731708], "unit": "score", "name": "Boyer", "value": 54.108877227722786}, {"lowerIsBetter": false, "replicates": [43166.666666666664], "unit": "score", "name": "RegExp", "value": 21.103899613899614}, {"lowerIsBetter": false, "replicates": [593.1198102016607], "unit": "score", "name": "Splay", "value": 137.39382600000002}, {"lowerIsBetter": false, "replicates": [4826.923076923077], "unit": "score", "name": "NavierStokes", "value": 307.4422310756973}], "name": "v8_7", "value": 20259.99714268329}]} 13:28:56 INFO - TinderboxPrint: TalosResult: {"graphserver": {"v8_7": {"url": "http://graphs.mozilla.org/graph.html#tests=[[230,132,43]]", "result": "20260.00"}, "kraken": {"url": "http://graphs.mozilla.org/graph.html#tests=[[232,132,43]]", "result": "1558.30"}, "dromaeo_css": {"url": "http://graphs.mozilla.org/graph.html#tests=[[72,132,43]]", "result": "6049.78"}}} 13:28:56 INFO - Return code: 0 13:28:56 INFO - Validating PERFHERDER_DATA against /builds/slave/test/build/tests/talos/treeherder-schemas/performance-artifact.json 13:28:56 INFO - # TBPL SUCCESS # 13:28:56 INFO - Running post-action listener: _resource_record_post_action 13:28:56 INFO - Running post-run listener: _resource_record_post_run 13:28:57 INFO - Total resource usage - Wall time: 1235s; CPU: 13.0%; Read bytes: 4096; Write bytes: 541917184; Read time: 16; Write time: 446316 13:28:57 INFO - install - Wall time: 16s; CPU: 14.0%; Read bytes: 0; Write bytes: 231342080; Read time: 0; Write time: 258548 13:28:57 INFO - run-tests - Wall time: 1219s; CPU: 13.0%; Read bytes: 4096; Write bytes: 310575104; Read time: 16; Write time: 187768 13:28:57 INFO - Running post-run listener: _upload_blobber_files 13:28:57 INFO - Blob upload gear active. 13:28:57 INFO - Preparing to upload files from /builds/slave/test/build/blobber_upload_dir. 13:28:57 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:28:57 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', 'Fx-Team-Non-PGO', '-d', '/builds/slave/test/build/blobber_upload_dir', '--output-manifest', '/builds/slave/test/build/uploaded_files.json'] 13:28:57 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 Fx-Team-Non-PGO -d /builds/slave/test/build/blobber_upload_dir --output-manifest /builds/slave/test/build/uploaded_files.json 13:28:57 INFO - (blobuploader) - INFO - Open directory for files ... 13:28:57 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log ... 13:28:57 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 13:28:57 INFO - (blobuploader) - INFO - Uploading, attempt #1. 13:28:58 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_errorsummary.log: uploaded 13:28:58 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 13:28:58 INFO - (blobuploader) - INFO - Done attempting. 13:28:58 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log ... 13:28:58 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 13:28:58 INFO - (blobuploader) - INFO - Uploading, attempt #1. 13:28:59 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_raw.log: uploaded 13:28:59 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 13:28:59 INFO - (blobuploader) - INFO - Done attempting. 13:28:59 INFO - (blobuploader) - INFO - Iteration through files over. 13:28:59 INFO - Return code: 0 13:28:59 INFO - rmtree: /builds/slave/test/build/uploaded_files.json 13:28:59 INFO - retry: Calling remove with args: ('/builds/slave/test/build/uploaded_files.json',), kwargs: {}, attempt #1 13:28:59 INFO - Setting buildbot property blobber_files to {"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/16f3a307f196e49bac491f13788680ac2739c9541b4b5121c9144fef3f389ff0961ca7c6297673f874112179610491cb8c3ed1c2fe5b3fdabb60b3723a3357ab", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/14f414a5b6120941bad70f0b10a1a761949c4c87790a64f801d7d16b1e81de9314aac103dd237666827055421d1cea5e60f226ed7c44b8dd895888306c18c44b"} 13:28:59 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test/properties/blobber_files 13:28:59 INFO - Writing to file /builds/slave/test/properties/blobber_files 13:28:59 INFO - Contents: 13:28:59 INFO - blobber_files:{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/16f3a307f196e49bac491f13788680ac2739c9541b4b5121c9144fef3f389ff0961ca7c6297673f874112179610491cb8c3ed1c2fe5b3fdabb60b3723a3357ab", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/14f414a5b6120941bad70f0b10a1a761949c4c87790a64f801d7d16b1e81de9314aac103dd237666827055421d1cea5e60f226ed7c44b8dd895888306c18c44b"} 13:28:59 INFO - Copying logs to upload dir... 13:28:59 INFO - mkdir: /builds/slave/test/build/upload/logs program finished with exit code 0 elapsedTime=1288.223945 ========= master_lag: 0.00 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 21 mins, 28 secs) (at 2016-01-13 13:28:59.512936) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-01-13 13:28:59.517096) ========= 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=3a3620fb28aea1604ab609ef000001d2-1452719001.9378-1378824880 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False blobber_files:{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/16f3a307f196e49bac491f13788680ac2739c9541b4b5121c9144fef3f389ff0961ca7c6297673f874112179610491cb8c3ed1c2fe5b3fdabb60b3723a3357ab", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/14f414a5b6120941bad70f0b10a1a761949c4c87790a64f801d7d16b1e81de9314aac103dd237666827055421d1cea5e60f226ed7c44b8dd895888306c18c44b"} build_url:https://queue.taskcluster.net/v1/task/Q-cw-MauRi-2bUM75RpNuA/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.tar.bz2 program finished with exit code 0 elapsedTime=0.011601 build_url: 'https://queue.taskcluster.net/v1/task/Q-cw-MauRi-2bUM75RpNuA/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.tar.bz2' blobber_files: '{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/16f3a307f196e49bac491f13788680ac2739c9541b4b5121c9144fef3f389ff0961ca7c6297673f874112179610491cb8c3ed1c2fe5b3fdabb60b3723a3357ab", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/14f414a5b6120941bad70f0b10a1a761949c4c87790a64f801d7d16b1e81de9314aac103dd237666827055421d1cea5e60f226ed7c44b8dd895888306c18c44b"}' ========= master_lag: 0.02 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-01-13 13:28:59.543930) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-01-13 13:28:59.544387) ========= 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=3a3620fb28aea1604ab609ef000001d2-1452719001.9378-1378824880 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004470 ========= master_lag: 0.08 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-01-13 13:28:59.629111) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2016-01-13 13:28:59.629971) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2016-01-13 13:28:59.630693) ========= ========= Total master_lag: 0.22 =========