builder: fx-team_ubuntu64_hw_test-dromaeojs-e10s slave: talos-linux64-ix-021 starttime: 1452902438.28 results: success (0) buildid: 20160115151523 builduid: ad935737f75f44dfb4597b71ef4b8411 revision: d26925accc511cc16a5aef23991de7e620fea4ae ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2016-01-15 16:00:38.283037) ========= master: http://buildbot-master103.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2016-01-15 16:00:38.283825) ========= ========= Started set props: basedir (results: 0, elapsed: 0 secs) (at 2016-01-15 16:00:38.284688) ========= 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=df17445c3590ff7897617a0e00000225-1452895563.611255-1710186019 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False /builds/slave/test program finished with exit code 0 elapsedTime=0.006373 basedir: '/builds/slave/test' ========= master_lag: 0.02 ========= ========= Finished set props: basedir (results: 0, elapsed: 0 secs) (at 2016-01-15 16:00:38.315558) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-01-15 16:00:38.315861) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-01-15 16:00:38.329768) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-01-15 16:00:38.330144) ========= 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=df17445c3590ff7897617a0e00000225-1452895563.611255-1710186019 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004616 ========= master_lag: 0.06 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-01-15 16:00:38.391836) ========= ========= Started set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2016-01-15 16:00:38.392197) ========= script_repo_url: https://hg.mozilla.org/build/mozharness ========= Finished set props: script_repo_url (results: 0, elapsed: 0 secs) (at 2016-01-15 16:00:38.392552) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-01-15 16:00:38.392868) ========= 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=df17445c3590ff7897617a0e00000225-1452895563.611255-1710186019 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2016-01-15 16:00:38-- 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% 225M=0s 2016-01-15 16:00:38 (225 MB/s) - `archiver_client.py' saved [12141/12141] program finished with exit code 0 elapsedTime=0.149658 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-01-15 16:00:38.557786) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-01-15 16:00:38.558113) ========= 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=df17445c3590ff7897617a0e00000225-1452895563.611255-1710186019 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.021143 ========= master_lag: 0.03 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-01-15 16:00:38.608010) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-01-15 16:00:38.608471) ========= bash -c 'python archiver_client.py mozharness --repo integration/fx-team --rev d26925accc511cc16a5aef23991de7e620fea4ae --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 d26925accc511cc16a5aef23991de7e620fea4ae --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=df17445c3590ff7897617a0e00000225-1452895563.611255-1710186019 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2016-01-15 16:00:38,842 truncating revision to first 12 chars 2016-01-15 16:00:38,842 Setting DEBUG logging. 2016-01-15 16:00:38,842 attempt 1/10 2016-01-15 16:00:38,842 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/integration/fx-team/d26925accc51?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2016-01-15 16:00:39,086 unpacking tar archive at: fx-team-d26925accc51/testing/mozharness/ program finished with exit code 0 elapsedTime=0.578065 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-01-15 16:00:39.199268) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-01-15 16:00:39.199583) ========= echo '%(revision)s' in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['echo', '%(revision)s'] 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=df17445c3590ff7897617a0e00000225-1452895563.611255-1710186019 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False %(revision)s program finished with exit code 0 elapsedTime=0.004713 script_repo_revision: '%(revision)s' ========= master_lag: 0.04 ========= ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-01-15 16:00:39.248597) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-01-15 16:00:39.248897) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-01-15 16:00:39.263218) ========= ========= Started tinderboxprint_script_revlink (results: 0, elapsed: 0 secs) (at 2016-01-15 16:00:39.263486) ========= TinderboxPrint: script_revlink: https://hg.mozilla.org/build/mozharness/rev/%(revision)s ========= Finished tinderboxprint_script_revlink (results: 0, elapsed: 0 secs) (at 2016-01-15 16:00:39.263891) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 21 mins, 22 secs) (at 2016-01-15 16:00:39.264179) ========= /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=df17445c3590ff7897617a0e00000225-1452895563.611255-1710186019 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 16:00:39 INFO - MultiFileLogger online at 20160115 16:00:39 in /builds/slave/test 16:00:39 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 16:00:39 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 16:00:39 INFO - {'append_to_log': False, 16:00:39 INFO - 'base_work_dir': '/builds/slave/test', 16:00:39 INFO - 'blob_upload_branch': 'Fx-Team-Non-PGO', 16:00:39 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 16:00:39 INFO - 'branch': 'Fx-Team-Non-PGO', 16:00:39 INFO - 'buildbot_json_path': 'buildprops.json', 16:00:39 INFO - 'config_files': ('talos/linux_config.py',), 16:00:39 INFO - 'default_actions': ('clobber', 16:00:39 INFO - 'read-buildbot-config', 16:00:39 INFO - 'download-and-extract', 16:00:39 INFO - 'populate-webroot', 16:00:39 INFO - 'create-virtualenv', 16:00:39 INFO - 'install', 16:00:39 INFO - 'run-tests'), 16:00:39 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 16:00:39 INFO - 'download_minidump_stackwalk': True, 16:00:39 INFO - 'download_symbols': 'ondemand', 16:00:39 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 16:00:39 INFO - 'tooltool.py': '/tools/tooltool.py', 16:00:39 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 16:00:39 INFO - '/tools/misc-python/virtualenv.py')}, 16:00:39 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 16:00:39 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 16:00:39 INFO - 'installer_path': 'installer.exe', 16:00:39 INFO - 'log_level': 'info', 16:00:39 INFO - 'log_name': 'talos', 16:00:39 INFO - 'log_to_console': True, 16:00:39 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 16:00:39 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 16:00:39 INFO - 'opt_config_files': (), 16:00:39 INFO - 'pip_index': False, 16:00:39 INFO - 'sps_profile': False, 16:00:39 INFO - 'sps_profile_interval': 0, 16:00:39 INFO - 'suite': 'dromaeojs-e10s', 16:00:39 INFO - 'system_bits': '32', 16:00:39 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 16:00:39 INFO - 'title': 'talos-linux64-ix-021', 16:00:39 INFO - 'tooltool_cache': '/builds/tooltool_cache', 16:00:39 INFO - 'use_talos_json': True, 16:00:39 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 16:00:39 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 16:00:39 INFO - 'work_dir': 'build'} 16:00:39 INFO - ##### 16:00:39 INFO - ##### Running clobber step. 16:00:39 INFO - ##### 16:00:39 INFO - Running pre-action listener: _resource_record_pre_action 16:00:39 INFO - Running main action method: clobber 16:00:39 INFO - rmtree: /builds/slave/test/build 16:00:39 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 16:00:40 INFO - Running post-action listener: _resource_record_post_action 16:00:40 INFO - ##### 16:00:40 INFO - ##### Running read-buildbot-config step. 16:00:40 INFO - ##### 16:00:40 INFO - Running pre-action listener: _resource_record_pre_action 16:00:40 INFO - Running main action method: read_buildbot_config 16:00:40 INFO - Using buildbot properties: 16:00:40 INFO - { 16:00:40 INFO - "project": "", 16:00:40 INFO - "product": "firefox", 16:00:40 INFO - "script_repo_revision": "production", 16:00:40 INFO - "builddir": "fx-team_ubuntu64_hw_test-dromaeojs-e10s", 16:00:40 INFO - "repository": "", 16:00:40 INFO - "buildername": "Ubuntu HW 12.04 x64 fx-team talos dromaeojs-e10s", 16:00:40 INFO - "buildid": "20160115151523", 16:00:40 INFO - "pgo_build": "False", 16:00:40 INFO - "basedir": "/builds/slave/test", 16:00:40 INFO - "buildnumber": 965, 16:00:40 INFO - "slavename": "talos-linux64-ix-021", 16:00:40 INFO - "master": "http://buildbot-master103.bb.releng.scl3.mozilla.com:8201/", 16:00:40 INFO - "platform": "ubuntu64_hw", 16:00:40 INFO - "scheduler": "tests-fx-team-linux64-talos", 16:00:40 INFO - "branch": "fx-team", 16:00:40 INFO - "repo_path": "integration/fx-team", 16:00:40 INFO - "revision": "d26925accc511cc16a5aef23991de7e620fea4ae", 16:00:40 INFO - "stage_platform": "linux64", 16:00:40 INFO - "builduid": "ad935737f75f44dfb4597b71ef4b8411", 16:00:40 INFO - "slavebuilddir": "test" 16:00:40 INFO - } 16:00:40 INFO - Found installer url https://queue.taskcluster.net/v1/task/RxFGf-SRTH2YSbdfoAuUlQ/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.tar.bz2. 16:00:40 INFO - Running post-action listener: _resource_record_post_action 16:00:40 INFO - ##### 16:00:40 INFO - ##### Running download-and-extract step. 16:00:40 INFO - ##### 16:00:40 INFO - Running pre-action listener: _resource_record_pre_action 16:00:40 INFO - Running main action method: download_and_extract 16:00:40 INFO - mkdir: /builds/slave/test/build/tests 16:00:40 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://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')]} 16:00:40 INFO - https://queue.taskcluster.net/v1/task/RxFGf-SRTH2YSbdfoAuUlQ/artifacts/public/build/test_packages.json matches https://queue.taskcluster.net 16:00:40 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/RxFGf-SRTH2YSbdfoAuUlQ/artifacts/public/build/test_packages.json 16:00:40 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/RxFGf-SRTH2YSbdfoAuUlQ/artifacts/public/build/test_packages.json 16:00:40 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/RxFGf-SRTH2YSbdfoAuUlQ/artifacts/public/build/test_packages.json to /builds/slave/test/build/test_packages.json 16:00:40 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/RxFGf-SRTH2YSbdfoAuUlQ/artifacts/public/build/test_packages.json', 'file_name': '/builds/slave/test/build/test_packages.json'}, attempt #1 16:00:43 INFO - Downloaded 1448 bytes. 16:00:43 INFO - Reading from file /builds/slave/test/build/test_packages.json 16:00:43 INFO - Using the following test package requirements: 16:00:43 INFO - {u'common': [u'firefox-46.0a1.en-US.linux-x86_64.common.tests.zip'], 16:00:43 INFO - u'cppunittest': [u'firefox-46.0a1.en-US.linux-x86_64.common.tests.zip', 16:00:43 INFO - u'firefox-46.0a1.en-US.linux-x86_64.cppunittest.tests.zip'], 16:00:43 INFO - u'gtest': [u'firefox-46.0a1.en-US.linux-x86_64.common.tests.zip', 16:00:43 INFO - u'firefox-46.0a1.en-US.linux-x86_64.gtest.tests.zip'], 16:00:43 INFO - u'jittest': [u'firefox-46.0a1.en-US.linux-x86_64.common.tests.zip', 16:00:43 INFO - u'jsshell-linux-x86_64.zip'], 16:00:43 INFO - u'mochitest': [u'firefox-46.0a1.en-US.linux-x86_64.common.tests.zip', 16:00:43 INFO - u'firefox-46.0a1.en-US.linux-x86_64.mochitest.tests.zip'], 16:00:43 INFO - u'mozbase': [u'firefox-46.0a1.en-US.linux-x86_64.common.tests.zip'], 16:00:43 INFO - u'reftest': [u'firefox-46.0a1.en-US.linux-x86_64.common.tests.zip', 16:00:43 INFO - u'firefox-46.0a1.en-US.linux-x86_64.reftest.tests.zip'], 16:00:43 INFO - u'talos': [u'firefox-46.0a1.en-US.linux-x86_64.common.tests.zip', 16:00:43 INFO - u'firefox-46.0a1.en-US.linux-x86_64.talos.tests.zip'], 16:00:43 INFO - u'web-platform': [u'firefox-46.0a1.en-US.linux-x86_64.common.tests.zip', 16:00:43 INFO - u'firefox-46.0a1.en-US.linux-x86_64.web-platform.tests.zip'], 16:00:43 INFO - u'webapprt': [u'firefox-46.0a1.en-US.linux-x86_64.common.tests.zip'], 16:00:43 INFO - u'xpcshell': [u'firefox-46.0a1.en-US.linux-x86_64.common.tests.zip', 16:00:43 INFO - u'firefox-46.0a1.en-US.linux-x86_64.xpcshell.tests.zip']} 16:00:43 INFO - Downloading packages: [u'firefox-46.0a1.en-US.linux-x86_64.common.tests.zip'] for test suite category: common 16:00:43 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 16:00:43 INFO - https://queue.taskcluster.net/v1/task/RxFGf-SRTH2YSbdfoAuUlQ/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 16:00:44 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/RxFGf-SRTH2YSbdfoAuUlQ/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip 16:00:44 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/RxFGf-SRTH2YSbdfoAuUlQ/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip 16:00:44 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/RxFGf-SRTH2YSbdfoAuUlQ/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 16:00:44 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/RxFGf-SRTH2YSbdfoAuUlQ/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 16:00:46 INFO - Downloaded 21172780 bytes. 16:00:46 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip', '-d', '/builds/slave/test/build/tests'] 16:00:46 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip -d /builds/slave/test/build/tests 16:00:47 INFO - Return code: 0 16:00:47 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 16:00:47 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 16:00:47 INFO - https://queue.taskcluster.net/v1/task/RxFGf-SRTH2YSbdfoAuUlQ/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 16:00:47 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/RxFGf-SRTH2YSbdfoAuUlQ/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip 16:00:47 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/RxFGf-SRTH2YSbdfoAuUlQ/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip 16:00:47 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/RxFGf-SRTH2YSbdfoAuUlQ/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 16:00:47 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/RxFGf-SRTH2YSbdfoAuUlQ/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 16:00:50 INFO - Downloaded 21172780 bytes. 16:00:50 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip', '-d', '/builds/slave/test/build/tests'] 16:00:50 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-46.0a1.en-US.linux-x86_64.common.tests.zip -d /builds/slave/test/build/tests 16:00:51 INFO - Return code: 0 16:00: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')]} 16:00:51 INFO - https://queue.taskcluster.net/v1/task/RxFGf-SRTH2YSbdfoAuUlQ/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.talos.tests.zip matches https://queue.taskcluster.net 16:00:51 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/RxFGf-SRTH2YSbdfoAuUlQ/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.talos.tests.zip 16:00:51 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/RxFGf-SRTH2YSbdfoAuUlQ/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.talos.tests.zip 16:00:51 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/RxFGf-SRTH2YSbdfoAuUlQ/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 16:00:51 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/RxFGf-SRTH2YSbdfoAuUlQ/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 16:00:53 INFO - Downloaded 11132144 bytes. 16:00:53 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-46.0a1.en-US.linux-x86_64.talos.tests.zip', '-d', '/builds/slave/test/build/tests'] 16:00:53 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-46.0a1.en-US.linux-x86_64.talos.tests.zip -d /builds/slave/test/build/tests 16:00:53 INFO - Return code: 0 16:00:53 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')]} 16:00:53 INFO - https://queue.taskcluster.net/v1/task/RxFGf-SRTH2YSbdfoAuUlQ/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.tar.bz2 matches https://queue.taskcluster.net 16:00:53 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/RxFGf-SRTH2YSbdfoAuUlQ/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.tar.bz2 16:00:53 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/RxFGf-SRTH2YSbdfoAuUlQ/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.tar.bz2 16:00:53 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/RxFGf-SRTH2YSbdfoAuUlQ/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 16:00:53 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/RxFGf-SRTH2YSbdfoAuUlQ/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 16:00:57 INFO - Downloaded 54127813 bytes. 16:00:57 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/RxFGf-SRTH2YSbdfoAuUlQ/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.tar.bz2 16:00:57 INFO - mkdir: /builds/slave/test/properties 16:00:57 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 16:00:57 INFO - Writing to file /builds/slave/test/properties/build_url 16:00:57 INFO - Contents: 16:00:57 INFO - build_url:https://queue.taskcluster.net/v1/task/RxFGf-SRTH2YSbdfoAuUlQ/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.tar.bz2 16:00:57 INFO - Running post-action listener: _resource_record_post_action 16:00:57 INFO - Running post-action listener: set_extra_try_arguments 16:00:57 INFO - ##### 16:00:57 INFO - ##### Running populate-webroot step. 16:00:57 INFO - ##### 16:00:57 INFO - Running pre-action listener: _resource_record_pre_action 16:00:57 INFO - Running main action method: populate_webroot 16:00:57 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 16:00:57 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 16:00:57 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 16:00:57 INFO - '--tppagecycles', 16:00:57 INFO - '7'], 16:00:57 INFO - 'tests': ['tsvgm']}}, 16:00:57 INFO - 'suites': {'chromez': {'tests': ['tresize', 'tcanvasmark']}, 16:00:57 INFO - 'chromez-e10s': {'talos_options': ['--e10s'], 16:00:57 INFO - 'tests': ['tresize', 'tcanvasmark']}, 16:00:57 INFO - 'dromaeojs': {'tests': ['dromaeo_css', 'kraken', 'v8_7']}, 16:00:57 INFO - 'dromaeojs-e10s': {'talos_options': ['--e10s'], 16:00:57 INFO - 'tests': ['dromaeo_css', 'kraken', 'v8_7']}, 16:00:57 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 16:00:57 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 16:00:57 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 16:00:57 INFO - 'talos_options': ['--e10s'], 16:00:57 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 16:00:57 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 16:00:57 INFO - 'tests': ['damp', 'tps']}, 16:00:57 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 16:00:57 INFO - 'talos_options': ['--e10s'], 16:00:57 INFO - 'tests': ['damp', 'tps']}, 16:00:57 INFO - 'g3': {'tests': ['dromaeo_dom']}, 16:00:57 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 16:00:57 INFO - 'other': {'tests': ['a11yr', 16:00:57 INFO - 'ts_paint', 16:00:57 INFO - 'tpaint', 16:00:57 INFO - 'sessionrestore', 16:00:57 INFO - 'sessionrestore_no_auto_restore']}, 16:00:57 INFO - 'other-e10s': {'talos_options': ['--e10s'], 16:00:57 INFO - 'tests': ['a11yr', 16:00:57 INFO - 'ts_paint', 16:00:57 INFO - 'tpaint', 16:00:57 INFO - 'sessionrestore', 16:00:57 INFO - 'sessionrestore_no_auto_restore']}, 16:00:57 INFO - 'other-e10s_l64': {'talos_options': ['--e10s'], 16:00:57 INFO - 'tests': ['a11yr', 16:00:57 INFO - 'ts_paint', 16:00:57 INFO - 'tpaint', 16:00:57 INFO - 'sessionrestore', 16:00:57 INFO - 'sessionrestore_no_auto_restore']}, 16:00:57 INFO - 'other-e10s_nol64': {'talos_options': ['--e10s'], 16:00:57 INFO - 'tests': ['a11yr', 16:00:57 INFO - 'ts_paint', 16:00:57 INFO - 'tpaint', 16:00:57 INFO - 'sessionrestore', 16:00:57 INFO - 'sessionrestore_no_auto_restore']}, 16:00:57 INFO - 'other_l64': {'tests': ['a11yr', 16:00:57 INFO - 'ts_paint', 16:00:57 INFO - 'tpaint', 16:00:57 INFO - 'sessionrestore', 16:00:57 INFO - 'sessionrestore_no_auto_restore']}, 16:00:57 INFO - 'other_nol64': {'tests': ['a11yr', 16:00:57 INFO - 'ts_paint', 16:00:57 INFO - 'tpaint', 16:00:57 INFO - 'sessionrestore', 16:00:57 INFO - 'sessionrestore_no_auto_restore']}, 16:00:57 INFO - 'svgr': {'tests': ['tsvgx', 16:00:57 INFO - 'tsvgr_opacity', 16:00:57 INFO - 'tart', 16:00:57 INFO - 'tscrollx', 16:00:57 INFO - 'cart']}, 16:00:57 INFO - 'svgr-e10s': {'talos_options': ['--e10s'], 16:00:57 INFO - 'tests': ['tsvgx', 16:00:57 INFO - 'tsvgr_opacity', 16:00:57 INFO - 'tart', 16:00:57 INFO - 'tscrollx', 16:00:57 INFO - 'cart']}, 16:00:57 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 16:00:57 INFO - 'tests': ['tp5o']}, 16:00:57 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 16:00:57 INFO - 'talos_options': ['--e10s'], 16:00:57 INFO - 'tests': ['tp5o']}, 16:00:57 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 16:00:57 INFO - 'talos_options': ['--xperf_path', 16:00:57 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 16:00:57 INFO - 'tests': ['tp5n']}, 16:00:57 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 16:00:57 INFO - 'talos_options': ['--e10s', 16:00:57 INFO - '--xperf_path', 16:00:57 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 16:00:57 INFO - 'tests': ['tp5n']}}, 16:00:57 INFO - 'talos.zip': {'path': '', 16:00:57 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 16:00:57 INFO - Running post-action listener: _resource_record_post_action 16:00:57 INFO - ##### 16:00:57 INFO - ##### Running create-virtualenv step. 16:00:57 INFO - ##### 16:00:57 INFO - Running pre-action listener: _resource_record_pre_action 16:00:57 INFO - Running main action method: create_virtualenv 16:00:57 INFO - Creating virtualenv /builds/slave/test/build/venv 16:00:57 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 16:00:57 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 16:00:57 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 16:00:57 INFO - Using real prefix '/usr' 16:00:57 INFO - New python executable in /builds/slave/test/build/venv/bin/python 16:00:58 INFO - Installing distribute.............................................................................................................................................................................................done. 16:01:00 INFO - Installing pip.................done. 16:01:00 INFO - Return code: 0 16:01:00 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 16:01: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')]} 16:01:00 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 16:01:00 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:01: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')]} 16:01:00 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 16:01:00 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:01: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 0x7f09478daf10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x18258a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x18f4dd0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x19873d0>, '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 0x18f2ed0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x18f3360>, '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': 'df17445c3590ff7897617a0e00000225-1452895563.611255-1710186019', '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 16:01: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 16:01: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 16:01:00 INFO - Using env: {'DISPLAY': ':0', 16:01:00 INFO - 'HOME': '/home/cltbld', 16:01:00 INFO - 'LANG': 'en_US.UTF-8', 16:01:00 INFO - 'LANGUAGE': 'en_US:en', 16:01:00 INFO - 'LOGNAME': 'cltbld', 16:01:00 INFO - 'MAIL': '/var/mail/cltbld', 16:01:00 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 16:01:00 INFO - 'MOZ_NO_REMOTE': '1', 16:01:00 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 16:01:00 INFO - 'NO_EM_RESTART': '1', 16:01:00 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 16:01:00 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 16:01:00 INFO - 'PWD': '/builds/slave/test', 16:01:00 INFO - 'SHELL': '/bin/bash', 16:01:00 INFO - 'SHLVL': '1', 16:01:00 INFO - 'TERM': 'linux', 16:01:00 INFO - 'TMOUT': '86400', 16:01:00 INFO - 'USER': 'cltbld', 16:01:00 INFO - 'XDG_SESSION_COOKIE': 'df17445c3590ff7897617a0e00000225-1452895563.611255-1710186019', 16:01:00 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 16:01:00 INFO - '_': '/tools/buildbot/bin/python'} 16:01:00 INFO - Ignoring indexes: https://pypi.python.org/simple/ 16:01: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 16:01:00 INFO - Cleaning up... 16:01:00 INFO - Return code: 0 16:01:00 INFO - Installing psutil>=0.7.1 into virtualenv /builds/slave/test/build/venv 16:01: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')]} 16:01:00 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 16:01:00 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:01: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')]} 16:01:00 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 16:01:00 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:01: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 0x7f09478daf10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x18258a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x18f4dd0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x19873d0>, '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 0x18f2ed0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x18f3360>, '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': 'df17445c3590ff7897617a0e00000225-1452895563.611255-1710186019', '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 16:01: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 16:01: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 16:01:00 INFO - Using env: {'DISPLAY': ':0', 16:01:00 INFO - 'HOME': '/home/cltbld', 16:01:00 INFO - 'LANG': 'en_US.UTF-8', 16:01:00 INFO - 'LANGUAGE': 'en_US:en', 16:01:00 INFO - 'LOGNAME': 'cltbld', 16:01:00 INFO - 'MAIL': '/var/mail/cltbld', 16:01:00 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 16:01:00 INFO - 'MOZ_NO_REMOTE': '1', 16:01:00 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 16:01:00 INFO - 'NO_EM_RESTART': '1', 16:01:00 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 16:01:00 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 16:01:00 INFO - 'PWD': '/builds/slave/test', 16:01:00 INFO - 'SHELL': '/bin/bash', 16:01:00 INFO - 'SHLVL': '1', 16:01:00 INFO - 'TERM': 'linux', 16:01:00 INFO - 'TMOUT': '86400', 16:01:00 INFO - 'USER': 'cltbld', 16:01:00 INFO - 'XDG_SESSION_COOKIE': 'df17445c3590ff7897617a0e00000225-1452895563.611255-1710186019', 16:01:00 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 16:01:00 INFO - '_': '/tools/buildbot/bin/python'} 16:01:00 INFO - Ignoring indexes: https://pypi.python.org/simple/ 16:01:00 INFO - Downloading/unpacking psutil>=0.7.1 16:01:00 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 16:01:00 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 16:01:00 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 16:01:00 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 16:01:00 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 16:01:00 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 16:01:02 INFO - Creating supposed download cache at /builds/slave/test/build/venv/cache 16:01:02 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fpsutil-3.1.1.tar.gz 16:01:02 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 16:01:02 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 16:01:02 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 16:01:02 INFO - Installing collected packages: psutil 16:01:02 INFO - Running setup.py install for psutil 16:01:02 INFO - building 'psutil._psutil_linux' extension 16:01:02 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 16:01:02 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 16:01:02 INFO - building 'psutil._psutil_posix' extension 16:01:02 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 16:01:02 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 16:01:02 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 16:01:02 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 16:01:03 INFO - Successfully installed psutil 16:01:03 INFO - Cleaning up... 16:01:03 INFO - Return code: 0 16:01:03 INFO - Installing mozsystemmonitor==0.0.0 into virtualenv /builds/slave/test/build/venv 16:01: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')]} 16:01:03 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 16:01:03 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:01: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')]} 16:01:03 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 16:01:03 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:01: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 0x7f09478daf10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x18258a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x18f4dd0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x19873d0>, '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 0x18f2ed0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x18f3360>, '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': 'df17445c3590ff7897617a0e00000225-1452895563.611255-1710186019', '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 16:01: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 16:01: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 16:01:03 INFO - Using env: {'DISPLAY': ':0', 16:01:03 INFO - 'HOME': '/home/cltbld', 16:01:03 INFO - 'LANG': 'en_US.UTF-8', 16:01:03 INFO - 'LANGUAGE': 'en_US:en', 16:01:03 INFO - 'LOGNAME': 'cltbld', 16:01:03 INFO - 'MAIL': '/var/mail/cltbld', 16:01:03 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 16:01:03 INFO - 'MOZ_NO_REMOTE': '1', 16:01:03 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 16:01:03 INFO - 'NO_EM_RESTART': '1', 16:01:03 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 16:01:03 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 16:01:03 INFO - 'PWD': '/builds/slave/test', 16:01:03 INFO - 'SHELL': '/bin/bash', 16:01:03 INFO - 'SHLVL': '1', 16:01:03 INFO - 'TERM': 'linux', 16:01:03 INFO - 'TMOUT': '86400', 16:01:03 INFO - 'USER': 'cltbld', 16:01:03 INFO - 'XDG_SESSION_COOKIE': 'df17445c3590ff7897617a0e00000225-1452895563.611255-1710186019', 16:01:03 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 16:01:03 INFO - '_': '/tools/buildbot/bin/python'} 16:01:03 INFO - Ignoring indexes: https://pypi.python.org/simple/ 16:01:03 INFO - Downloading/unpacking mozsystemmonitor==0.0.0 16:01: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 16:01: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 16:01: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 16:01: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 16:01: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 16:01: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 16:01:05 INFO - Downloading mozsystemmonitor-0.0.tar.gz 16:01:05 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fmozsystemmonitor-0.0.tar.gz 16:01:05 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 16:01: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) 16:01:05 INFO - Installing collected packages: mozsystemmonitor 16:01:05 INFO - Running setup.py install for mozsystemmonitor 16:01:05 INFO - Successfully installed mozsystemmonitor 16:01:05 INFO - Cleaning up... 16:01:05 INFO - Return code: 0 16:01:05 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 16:01: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')]} 16:01:05 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 16:01:05 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:01: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')]} 16:01:05 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 16:01:05 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:01: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 0x7f09478daf10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x18258a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x18f4dd0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x19873d0>, '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 0x18f2ed0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x18f3360>, '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': 'df17445c3590ff7897617a0e00000225-1452895563.611255-1710186019', '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 16:01: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 16:01: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 16:01:05 INFO - Using env: {'DISPLAY': ':0', 16:01:05 INFO - 'HOME': '/home/cltbld', 16:01:05 INFO - 'LANG': 'en_US.UTF-8', 16:01:05 INFO - 'LANGUAGE': 'en_US:en', 16:01:05 INFO - 'LOGNAME': 'cltbld', 16:01:05 INFO - 'MAIL': '/var/mail/cltbld', 16:01:05 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 16:01:05 INFO - 'MOZ_NO_REMOTE': '1', 16:01:05 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 16:01:05 INFO - 'NO_EM_RESTART': '1', 16:01:05 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 16:01:05 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 16:01:05 INFO - 'PWD': '/builds/slave/test', 16:01:05 INFO - 'SHELL': '/bin/bash', 16:01:05 INFO - 'SHLVL': '1', 16:01:05 INFO - 'TERM': 'linux', 16:01:05 INFO - 'TMOUT': '86400', 16:01:05 INFO - 'USER': 'cltbld', 16:01:05 INFO - 'XDG_SESSION_COOKIE': 'df17445c3590ff7897617a0e00000225-1452895563.611255-1710186019', 16:01:05 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 16:01:05 INFO - '_': '/tools/buildbot/bin/python'} 16:01:05 INFO - Ignoring indexes: https://pypi.python.org/simple/ 16:01:05 INFO - Downloading/unpacking blobuploader==1.2.4 16:01: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 16:01: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 16:01: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 16:01: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 16:01: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 16:01: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 16:01:07 INFO - Downloading blobuploader-1.2.4.tar.gz 16:01:07 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fblobuploader-1.2.4.tar.gz 16:01:07 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 16:01:07 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 16:01: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 16:01: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 16:01: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 16:01: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 16:01: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 16:01: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 16:01:07 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Frequests-1.2.3.tar.gz 16:01:07 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 16:01:07 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 16:01: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 16:01: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 16:01: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 16:01: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 16:01: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 16:01: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 16:01:07 INFO - Downloading docopt-0.6.1.tar.gz 16:01:07 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fdocopt-0.6.1.tar.gz 16:01:07 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 16:01:07 INFO - Installing collected packages: blobuploader, requests, docopt 16:01:07 INFO - Running setup.py install for blobuploader 16:01:07 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 16:01:07 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 16:01:07 INFO - Running setup.py install for requests 16:01:08 INFO - Running setup.py install for docopt 16:01:08 INFO - Successfully installed blobuploader requests docopt 16:01:08 INFO - Cleaning up... 16:01:08 INFO - Return code: 0 16:01:08 INFO - Installing None into virtualenv /builds/slave/test/build/venv 16:01: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')]} 16:01:08 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 16:01:08 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:01: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')]} 16:01:08 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 16:01:08 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:01: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 0x7f09478daf10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x18258a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x18f4dd0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x19873d0>, '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 0x18f2ed0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x18f3360>, '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': 'df17445c3590ff7897617a0e00000225-1452895563.611255-1710186019', '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 16:01: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 16:01: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 16:01:08 INFO - Using env: {'DISPLAY': ':0', 16:01:08 INFO - 'HOME': '/home/cltbld', 16:01:08 INFO - 'LANG': 'en_US.UTF-8', 16:01:08 INFO - 'LANGUAGE': 'en_US:en', 16:01:08 INFO - 'LOGNAME': 'cltbld', 16:01:08 INFO - 'MAIL': '/var/mail/cltbld', 16:01:08 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 16:01:08 INFO - 'MOZ_NO_REMOTE': '1', 16:01:08 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 16:01:08 INFO - 'NO_EM_RESTART': '1', 16:01:08 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 16:01:08 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 16:01:08 INFO - 'PWD': '/builds/slave/test', 16:01:08 INFO - 'SHELL': '/bin/bash', 16:01:08 INFO - 'SHLVL': '1', 16:01:08 INFO - 'TERM': 'linux', 16:01:08 INFO - 'TMOUT': '86400', 16:01:08 INFO - 'USER': 'cltbld', 16:01:08 INFO - 'XDG_SESSION_COOKIE': 'df17445c3590ff7897617a0e00000225-1452895563.611255-1710186019', 16:01:08 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 16:01:08 INFO - '_': '/tools/buildbot/bin/python'} 16:01:08 INFO - Ignoring indexes: https://pypi.python.org/simple/ 16:01:08 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 16:01:08 INFO - Running setup.py (path:/tmp/pip-0l10bb-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 16:01:08 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 16:01:08 INFO - Running setup.py (path:/tmp/pip-mHFl9t-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 16:01:08 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 16:01:08 INFO - Running setup.py (path:/tmp/pip-eBLjgV-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 16:01:08 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 16:01:08 INFO - Running setup.py (path:/tmp/pip-tWovQQ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 16:01:09 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 16:01:09 INFO - Running setup.py (path:/tmp/pip-1aHf1J-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 16:01:09 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 16:01:09 INFO - Running setup.py (path:/tmp/pip-RWYOf9-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 16:01:09 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 16:01:09 INFO - Running setup.py (path:/tmp/pip-FhMMLH-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 16:01:09 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 16:01:09 INFO - Running setup.py (path:/tmp/pip-bXiFPu-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 16:01:09 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 16:01:09 INFO - Running setup.py (path:/tmp/pip-ouePQD-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 16:01:09 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 16:01:09 INFO - Running setup.py (path:/tmp/pip-1lucUS-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 16:01:09 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 16:01:09 INFO - Running setup.py (path:/tmp/pip-EgID_Y-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 16:01:09 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 16:01:09 INFO - Running setup.py (path:/tmp/pip-j9jqSM-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 16:01:09 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 16:01:09 INFO - Running setup.py (path:/tmp/pip-UgBbFj-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 16:01:09 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 16:01:09 INFO - Running setup.py (path:/tmp/pip-WYoqJo-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 16:01:09 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 16:01:09 INFO - Running setup.py (path:/tmp/pip-IIIAFz-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 16:01:09 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 16:01:09 INFO - Running setup.py (path:/tmp/pip-BOWAtt-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 16:01:09 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 16:01:09 INFO - Running setup.py (path:/tmp/pip-gv_2WK-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 16:01:09 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 16:01:09 INFO - Running setup.py install for manifestparser 16:01:10 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 16:01:10 INFO - Running setup.py install for mozcrash 16:01:10 INFO - Running setup.py install for mozdebug 16:01:10 INFO - Running setup.py install for mozdevice 16:01:10 INFO - Installing sutini script to /builds/slave/test/build/venv/bin 16:01:10 INFO - Installing dm script to /builds/slave/test/build/venv/bin 16:01:10 INFO - Running setup.py install for mozfile 16:01:10 INFO - Running setup.py install for mozhttpd 16:01:10 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 16:01:10 INFO - Running setup.py install for mozinfo 16:01:10 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 16:01:10 INFO - Running setup.py install for mozInstall 16:01:10 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 16:01:10 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 16:01:10 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 16:01:10 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 16:01:10 INFO - Running setup.py install for mozleak 16:01:10 INFO - Running setup.py install for mozlog 16:01:10 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 16:01:10 INFO - Running setup.py install for moznetwork 16:01:11 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 16:01:11 INFO - Running setup.py install for mozprocess 16:01:11 INFO - Running setup.py install for mozprofile 16:01:11 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 16:01:11 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 16:01:11 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 16:01:11 INFO - Running setup.py install for mozrunner 16:01:11 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 16:01:11 INFO - Running setup.py install for mozscreenshot 16:01:11 INFO - Running setup.py install for moztest 16:01:11 INFO - Running setup.py install for mozversion 16:01:11 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 16:01:11 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 16:01:11 INFO - Cleaning up... 16:01:11 INFO - Return code: 0 16:01:11 INFO - Installing None into virtualenv /builds/slave/test/build/venv 16:01:11 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://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')]} 16:01:11 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 16:01:11 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:01:11 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://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')]} 16:01:11 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 16:01:11 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:01:11 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 0x7f09478daf10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x18258a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x18f4dd0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x19873d0>, '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 0x18f2ed0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x18f3360>, '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': 'df17445c3590ff7897617a0e00000225-1452895563.611255-1710186019', '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 16:01:11 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 16:01:11 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 16:01:11 INFO - Using env: {'DISPLAY': ':0', 16:01:11 INFO - 'HOME': '/home/cltbld', 16:01:11 INFO - 'LANG': 'en_US.UTF-8', 16:01:11 INFO - 'LANGUAGE': 'en_US:en', 16:01:11 INFO - 'LOGNAME': 'cltbld', 16:01:11 INFO - 'MAIL': '/var/mail/cltbld', 16:01:11 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 16:01:11 INFO - 'MOZ_NO_REMOTE': '1', 16:01:11 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 16:01:11 INFO - 'NO_EM_RESTART': '1', 16:01:11 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 16:01:11 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 16:01:11 INFO - 'PWD': '/builds/slave/test', 16:01:11 INFO - 'SHELL': '/bin/bash', 16:01:11 INFO - 'SHLVL': '1', 16:01:11 INFO - 'TERM': 'linux', 16:01:11 INFO - 'TMOUT': '86400', 16:01:11 INFO - 'USER': 'cltbld', 16:01:11 INFO - 'XDG_SESSION_COOKIE': 'df17445c3590ff7897617a0e00000225-1452895563.611255-1710186019', 16:01:11 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 16:01:11 INFO - '_': '/tools/buildbot/bin/python'} 16:01:11 INFO - Ignoring indexes: https://pypi.python.org/simple/ 16:01:11 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 16:01:11 INFO - Running setup.py (path:/tmp/pip-oc3ynE-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 16:01:11 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)) 16:01:11 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 16:01:11 INFO - Running setup.py (path:/tmp/pip-8WfYSe-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 16:01: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)) 16:01:12 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 16:01:12 INFO - Running setup.py (path:/tmp/pip-H0RgjX-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 16:01: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)) 16:01:12 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 16:01:12 INFO - Running setup.py (path:/tmp/pip-6I9SNY-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 16:01: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)) 16:01:12 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 16:01:12 INFO - Running setup.py (path:/tmp/pip-fzbPb4-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 16:01: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)) 16:01:12 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 16:01:12 INFO - Running setup.py (path:/tmp/pip-ouyn3B-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 16:01: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)) 16:01:12 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 16:01:12 INFO - Running setup.py (path:/tmp/pip-ANjIbs-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 16:01: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)) 16:01:12 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 16:01:12 INFO - Running setup.py (path:/tmp/pip-DFbZTR-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 16:01: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)) 16:01:12 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 16:01:12 INFO - Running setup.py (path:/tmp/pip-2K1Aum-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 16:01: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)) 16:01:12 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 16:01:12 INFO - Running setup.py (path:/tmp/pip-ghNsuc-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 16:01:12 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)) 16:01:12 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 16:01:12 INFO - Running setup.py (path:/tmp/pip-XU4p9V-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 16:01:12 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)) 16:01:12 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 16:01:12 INFO - Running setup.py (path:/tmp/pip-ZXMj4o-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 16:01:12 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)) 16:01:12 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 16:01:12 INFO - Running setup.py (path:/tmp/pip-mVJOrl-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 16:01:12 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)) 16:01:12 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 16:01:12 INFO - Running setup.py (path:/tmp/pip-CAHHuC-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 16:01:12 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)) 16:01:12 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 16:01:12 INFO - Running setup.py (path:/tmp/pip-SsB3Ys-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 16:01: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)) 16:01:13 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 16:01:13 INFO - Running setup.py (path:/tmp/pip-Smd6Qk-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 16:01: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)) 16:01:13 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 16:01:13 INFO - Running setup.py (path:/tmp/pip-ijQdkR-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 16:01: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)) 16:01: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)) 16:01: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)) 16:01: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)) 16:01: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)) 16:01: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)) 16:01:13 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.1->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 16:01: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 16:01: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 16:01: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 16:01: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 16:01: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 16:01: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 16:01:14 INFO - Downloading blessings-1.5.1.tar.gz 16:01:14 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 16:01:14 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 16:01:14 INFO - Installing collected packages: blessings 16:01:14 INFO - Running setup.py install for blessings 16:01:15 INFO - Successfully installed blessings 16:01:15 INFO - Cleaning up... 16:01:15 INFO - Return code: 0 16:01:15 INFO - Done creating virtualenv /builds/slave/test/build/venv. 16:01:15 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 16:01:15 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 16:01:15 INFO - Reading from file tmpfile_stdout 16:01:15 INFO - Current package versions: 16:01:15 INFO - argparse == 1.2.1 16:01:15 INFO - blessings == 1.5.1 16:01:15 INFO - blobuploader == 1.2.4 16:01:15 INFO - docopt == 0.6.1 16:01:15 INFO - manifestparser == 1.1 16:01:15 INFO - mozInstall == 1.12 16:01:15 INFO - mozcrash == 0.16 16:01:15 INFO - mozdebug == 0.1 16:01:15 INFO - mozdevice == 0.48 16:01:15 INFO - mozfile == 1.2 16:01:15 INFO - mozhttpd == 0.7 16:01:15 INFO - mozinfo == 0.9 16:01:15 INFO - mozleak == 0.1 16:01:15 INFO - mozlog == 3.1 16:01:15 INFO - moznetwork == 0.27 16:01:15 INFO - mozprocess == 0.22 16:01:15 INFO - mozprofile == 0.28 16:01:15 INFO - mozrunner == 6.11 16:01:15 INFO - mozscreenshot == 0.1 16:01:15 INFO - mozsystemmonitor == 0.0 16:01:15 INFO - moztest == 0.7 16:01:15 INFO - mozversion == 1.4 16:01:15 INFO - psutil == 3.1.1 16:01:15 INFO - requests == 1.2.3 16:01:15 INFO - wsgiref == 0.1.2 16:01:15 INFO - Installing None into virtualenv /builds/slave/test/build/venv 16:01: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')]} 16:01:15 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 16:01:15 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:01: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')]} 16:01:15 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 16:01:15 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:01: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 0x7f09478daf10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x18258a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x18f4dd0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x19873d0>, '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 0x18f2ed0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x18f3360>, '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': 'df17445c3590ff7897617a0e00000225-1452895563.611255-1710186019', '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 16:01: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 16:01: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 16:01:15 INFO - Using env: {'DISPLAY': ':0', 16:01:15 INFO - 'HOME': '/home/cltbld', 16:01:15 INFO - 'LANG': 'en_US.UTF-8', 16:01:15 INFO - 'LANGUAGE': 'en_US:en', 16:01:15 INFO - 'LOGNAME': 'cltbld', 16:01:15 INFO - 'MAIL': '/var/mail/cltbld', 16:01:15 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 16:01:15 INFO - 'MOZ_NO_REMOTE': '1', 16:01:15 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 16:01:15 INFO - 'NO_EM_RESTART': '1', 16:01:15 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 16:01:15 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 16:01:15 INFO - 'PWD': '/builds/slave/test', 16:01:15 INFO - 'SHELL': '/bin/bash', 16:01:15 INFO - 'SHLVL': '1', 16:01:15 INFO - 'TERM': 'linux', 16:01:15 INFO - 'TMOUT': '86400', 16:01:15 INFO - 'USER': 'cltbld', 16:01:15 INFO - 'XDG_SESSION_COOKIE': 'df17445c3590ff7897617a0e00000225-1452895563.611255-1710186019', 16:01:15 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 16:01:15 INFO - '_': '/tools/buildbot/bin/python'} 16:01:15 INFO - Ignoring indexes: https://pypi.python.org/simple/ 16:01: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)) 16:01: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)) 16:01: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)) 16:01: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)) 16:01: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)) 16:01: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)) 16:01: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)) 16:01: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)) 16:01: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)) 16:01: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)) 16:01: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)) 16:01:15 INFO - Cleaning up... 16:01:15 INFO - Return code: 0 16:01:15 INFO - Installing jsonschema into virtualenv /builds/slave/test/build/venv 16:01: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')]} 16:01:15 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 16:01:15 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:01: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')]} 16:01:15 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 16:01:15 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:01: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 0x7f09478daf10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x18258a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x18f4dd0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x19873d0>, '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 0x18f2ed0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x18f3360>, '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': 'df17445c3590ff7897617a0e00000225-1452895563.611255-1710186019', '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 16:01: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 16:01: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 16:01:15 INFO - Using env: {'DISPLAY': ':0', 16:01:15 INFO - 'HOME': '/home/cltbld', 16:01:15 INFO - 'LANG': 'en_US.UTF-8', 16:01:15 INFO - 'LANGUAGE': 'en_US:en', 16:01:15 INFO - 'LOGNAME': 'cltbld', 16:01:15 INFO - 'MAIL': '/var/mail/cltbld', 16:01:15 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 16:01:15 INFO - 'MOZ_NO_REMOTE': '1', 16:01:15 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 16:01:15 INFO - 'NO_EM_RESTART': '1', 16:01:15 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 16:01:15 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 16:01:15 INFO - 'PWD': '/builds/slave/test', 16:01:15 INFO - 'SHELL': '/bin/bash', 16:01:15 INFO - 'SHLVL': '1', 16:01:15 INFO - 'TERM': 'linux', 16:01:15 INFO - 'TMOUT': '86400', 16:01:15 INFO - 'USER': 'cltbld', 16:01:15 INFO - 'XDG_SESSION_COOKIE': 'df17445c3590ff7897617a0e00000225-1452895563.611255-1710186019', 16:01:15 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 16:01:15 INFO - '_': '/tools/buildbot/bin/python'} 16:01:15 INFO - Ignoring indexes: https://pypi.python.org/simple/ 16:01:15 INFO - Downloading/unpacking jsonschema 16:01:15 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 16:01:15 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 16:01:15 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 16:01:15 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 16:01:15 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 16:01:15 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 16:01:17 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 16:01: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 16:01:17 INFO - Downloading/unpacking functools32 (from jsonschema) 16:01: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 16:01: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 16:01: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 16:01: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 16:01: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 16:01: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 16:01:17 INFO - Downloading functools32-3.2.3-2.tar.gz 16:01:17 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Ffunctools32-3.2.3-2.tar.gz 16:01:17 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/functools32/setup.py) egg_info for package functools32 16:01:17 INFO - warning: no files found matching '*.txt' 16:01:17 INFO - no previously-included directories found matching 'build' 16:01:17 INFO - no previously-included directories found matching 'dist' 16:01:17 INFO - no previously-included directories found matching '.git*' 16:01:17 INFO - Installing collected packages: jsonschema, functools32 16:01:17 INFO - Running setup.py install for functools32 16:01:17 INFO - warning: no files found matching '*.txt' 16:01:17 INFO - no previously-included directories found matching 'build' 16:01:17 INFO - no previously-included directories found matching 'dist' 16:01:17 INFO - no previously-included directories found matching '.git*' 16:01:17 INFO - Successfully installed jsonschema functools32 16:01:17 INFO - Cleaning up... 16:01:17 INFO - Return code: 0 16:01:17 INFO - Installing flake8 into virtualenv /builds/slave/test/build/venv 16:01:17 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')]} 16:01:17 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 16:01:17 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:01:17 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')]} 16:01:17 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 16:01:17 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:01:17 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 0x7f09478daf10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x18258a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x18f4dd0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x19873d0>, '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 0x18f2ed0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x18f3360>, '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': 'df17445c3590ff7897617a0e00000225-1452895563.611255-1710186019', '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 16:01:17 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 16:01:17 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 16:01:17 INFO - Using env: {'DISPLAY': ':0', 16:01:17 INFO - 'HOME': '/home/cltbld', 16:01:17 INFO - 'LANG': 'en_US.UTF-8', 16:01:17 INFO - 'LANGUAGE': 'en_US:en', 16:01:17 INFO - 'LOGNAME': 'cltbld', 16:01:17 INFO - 'MAIL': '/var/mail/cltbld', 16:01:17 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 16:01:17 INFO - 'MOZ_NO_REMOTE': '1', 16:01:17 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 16:01:17 INFO - 'NO_EM_RESTART': '1', 16:01:17 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 16:01:17 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 16:01:17 INFO - 'PWD': '/builds/slave/test', 16:01:17 INFO - 'SHELL': '/bin/bash', 16:01:17 INFO - 'SHLVL': '1', 16:01:17 INFO - 'TERM': 'linux', 16:01:17 INFO - 'TMOUT': '86400', 16:01:17 INFO - 'USER': 'cltbld', 16:01:17 INFO - 'XDG_SESSION_COOKIE': 'df17445c3590ff7897617a0e00000225-1452895563.611255-1710186019', 16:01:17 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 16:01:17 INFO - '_': '/tools/buildbot/bin/python'} 16:01:18 INFO - Ignoring indexes: https://pypi.python.org/simple/ 16:01:18 INFO - Downloading/unpacking flake8 16:01: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 16:01: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 16:01: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 16:01: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 16:01: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 16:01: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 16:01:19 INFO - Downloading flake8-2.5.0-py2.py3-none-any.whl 16:01:19 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 16:01:19 INFO - Downloading/unpacking mccabe>=0.2.1,<0.4 (from flake8) 16:01:19 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 16:01:19 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 16:01:19 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 16:01:19 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 16:01:19 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 16:01:19 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 16:01:20 INFO - Downloading mccabe-0.3.1-py2.py3-none-any.whl 16:01: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 16:01:20 INFO - Downloading/unpacking pyflakes>=0.8.1,<1.1 (from flake8) 16:01: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 16:01: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 16:01: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 16:01: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 16:01: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 16:01: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 16:01: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 16:01:20 INFO - Downloading/unpacking pep8>=1.5.7,!=1.6.0,!=1.6.1,!=1.6.2 (from flake8) 16:01: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 16:01: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 16:01: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 16:01: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 16:01: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 16:01: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 16:01:20 INFO - Storing download in cache at ./venv/cache/http%3A%2F%2Fpypi.pvt.build.mozilla.org%2Fpub%2Fpep8-1.5.7.tar.gz 16:01:20 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/pep8/setup.py) egg_info for package pep8 16:01:20 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 16:01:20 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 16:01:20 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 16:01:20 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 16:01:20 INFO - no previously-included directories found matching 'docs/_build' 16:01:20 INFO - Installing collected packages: flake8, mccabe, pyflakes, pep8 16:01:20 INFO - Running setup.py install for pep8 16:01:20 INFO - warning: no previously-included files matching '*.pyc' found under directory 'docs' 16:01:20 INFO - warning: no previously-included files matching '*.pyo' found under directory 'docs' 16:01:20 INFO - warning: no previously-included files matching '*.pyc' found under directory 'testsuite' 16:01:20 INFO - warning: no previously-included files matching '*.pyo' found under directory 'testsuite' 16:01:20 INFO - no previously-included directories found matching 'docs/_build' 16:01:20 INFO - Installing pep8 script to /builds/slave/test/build/venv/bin 16:01:20 INFO - Successfully installed flake8 mccabe pyflakes pep8 16:01:20 INFO - Cleaning up... 16:01:20 INFO - Return code: 0 16:01:20 INFO - Running post-action listener: _resource_record_post_action 16:01:20 INFO - Running post-action listener: _start_resource_monitoring 16:01:20 INFO - Starting resource monitoring. 16:01:20 INFO - ##### 16:01:20 INFO - ##### Running install step. 16:01:20 INFO - ##### 16:01:20 INFO - Running pre-action listener: _resource_record_pre_action 16:01:20 INFO - Running main action method: install 16:01:20 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 16:01:20 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 16:01:21 INFO - Reading from file tmpfile_stdout 16:01:21 INFO - Detecting whether we're running mozinstall >=1.0... 16:01:21 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 16:01:21 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 16:01:21 INFO - Reading from file tmpfile_stdout 16:01:21 INFO - Output received: 16:01:21 INFO - Usage: mozinstall [options] installer 16:01:21 INFO - Options: 16:01:21 INFO - -h, --help show this help message and exit 16:01:21 INFO - -d DEST, --destination=DEST 16:01:21 INFO - Directory to install application into. [default: 16:01:21 INFO - "/builds/slave/test"] 16:01:21 INFO - --app=APP Application being installed. [default: firefox] 16:01:21 INFO - mkdir: /builds/slave/test/build/application 16:01: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'] 16:01: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 16:01:37 INFO - Reading from file tmpfile_stdout 16:01:37 INFO - Output received: 16:01:37 INFO - /builds/slave/test/build/application/firefox/firefox 16:01:37 INFO - Running post-action listener: _resource_record_post_action 16:01:37 INFO - ##### 16:01:37 INFO - ##### Running run-tests step. 16:01:37 INFO - ##### 16:01:37 INFO - Running pre-action listener: _resource_record_pre_action 16:01:37 INFO - Running main action method: run_tests 16:01:37 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 16:01:37 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 16:01:37 INFO - Python 2.7.3 16:01:37 INFO - Return code: 0 16:01:37 INFO - grabbing minidump binary from tooltool 16:01: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')]} 16:01: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 0x19873d0>, '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 0x18f2ed0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x18f3360>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 16:01: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 16:01: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 16:01:37 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 16:01:37 INFO - Return code: 0 16:01:37 INFO - Chmoding /builds/slave/test/build/linux64-minidump_stackwalk to 0755 16:01:37 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 16:01:37 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 16:01:37 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/linux64-minidump_stackwalk 16:01:37 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 16:01:37 INFO - Running command: ['/builds/slave/test/build/venv/bin/flake8', '/builds/slave/test/build/tests/talos/talos'] 16:01:37 INFO - Copy/paste: /builds/slave/test/build/venv/bin/flake8 /builds/slave/test/build/tests/talos/talos 16:01:38 INFO - Return code: 0 16:01: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/RxFGf-SRTH2YSbdfoAuUlQ/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-021', '--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 16:01: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/RxFGf-SRTH2YSbdfoAuUlQ/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.crashreporter-symbols.zip --title talos-linux64-ix-021 --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 16:01:38 INFO - Using env: {'DISPLAY': ':0', 16:01:38 INFO - 'HOME': '/home/cltbld', 16:01:38 INFO - 'LANG': 'en_US.UTF-8', 16:01:38 INFO - 'LANGUAGE': 'en_US:en', 16:01:38 INFO - 'LOGNAME': 'cltbld', 16:01:38 INFO - 'MAIL': '/var/mail/cltbld', 16:01:38 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 16:01:38 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/linux64-minidump_stackwalk', 16:01:38 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 16:01:38 INFO - 'MOZ_NO_REMOTE': '1', 16:01:38 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 16:01:38 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 16:01:38 INFO - 'NO_EM_RESTART': '1', 16:01:38 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 16:01:38 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 16:01:38 INFO - 'PWD': '/builds/slave/test', 16:01:38 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 16:01:38 INFO - 'SHELL': '/bin/bash', 16:01:38 INFO - 'SHLVL': '1', 16:01:38 INFO - 'TERM': 'linux', 16:01:38 INFO - 'TMOUT': '86400', 16:01:38 INFO - 'USER': 'cltbld', 16:01:38 INFO - 'XDG_SESSION_COOKIE': 'df17445c3590ff7897617a0e00000225-1452895563.611255-1710186019', 16:01:38 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 16:01:38 INFO - '_': '/tools/buildbot/bin/python'} 16:01: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/RxFGf-SRTH2YSbdfoAuUlQ/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-021', '--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 16:01:38 INFO - mozversion application_buildid: 20160115151523 16:01:38 INFO - mozversion application_changeset: d26925accc511cc16a5aef23991de7e620fea4ae 16:01:38 INFO - mozversion application_display_name: Nightly 16:01:38 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 16:01:38 INFO - mozversion application_name: Firefox 16:01:38 INFO - mozversion application_remotingname: firefox 16:01:38 INFO - mozversion application_repository: https://hg.mozilla.org/integration/fx-team 16:01:38 INFO - mozversion application_vendor: Mozilla 16:01:38 INFO - mozversion application_version: 46.0a1 16:01:38 INFO - mozversion platform_buildid: 20160115151523 16:01:38 INFO - mozversion platform_changeset: d26925accc511cc16a5aef23991de7e620fea4ae 16:01:38 INFO - mozversion platform_repository: https://hg.mozilla.org/integration/fx-team 16:01:38 INFO - mozversion platform_version: 46.0a1 16:01:38 INFO - using testdate: 1452902498 16:01:38 INFO - actual date: 1452902498 16:01:38 INFO - starting webserver on 'localhost:32962' 16:01:38 INFO - SUITE-START | Running 3 tests 16:01:38 INFO - TEST-START | dromaeo_css 16:01:38 INFO - operating with platform_type : linux_ 16:01:38 INFO - Initialising browser for dromaeo_css test... 16:01:38 INFO - TEST-INFO | started process 12179 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpHXYlfb/profile http://localhost:32962/getInfo.html) 16:01:42 INFO - PROCESS | 12179 | 16:01:42 INFO - PROCESS | 12179 | (process:12262): GLib-CRITICAL **: g_path_get_basename: assertion `file_name != NULL' failed 16:01:43 INFO - PROCESS | 12179 | __metrics Screen width/height:1600/1200 16:01:43 INFO - PROCESS | 12179 | colorDepth:24 16:01:43 INFO - PROCESS | 12179 | Browser inner width/height: 1024/697 16:01:43 INFO - PROCESS | 12179 | __metrics 16:01:44 INFO - PROCESS | 12179 | JavaScript error: resource://gre/modules/PerformanceStats.jsm, line 211: NS_ERROR_NOT_AVAILABLE: Component returned failure code: 0x80040111 (NS_ERROR_NOT_AVAILABLE) [nsIPerformanceStatsService.isMonitoringJank] 16:01:45 INFO - TEST-INFO | 12179: exit 0 16:01:45 INFO - Browser initialized. 16:01:45 INFO - Running cycle 1/1 for dromaeo_css test... 16:01:45 INFO - TEST-INFO | started process 12311 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpHXYlfb/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 16:01:46 INFO - PROCESS | 12311 | 16:01:46 INFO - PROCESS | 12311 | (process:12367): GLib-CRITICAL **: g_path_get_basename: assertion `file_name != NULL' failed 16:01:57 INFO - PROCESS | 12311 | RSS: Main: 150712320 16:01:57 INFO - PROCESS | 12311 | 16:02:46 INFO - PROCESS | 12311 | 1452902566748 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] 16:04:57 INFO - PROCESS | 12311 | Cycle 1(1): loaded http://localhost:32962/tests/dromaeo/cssquery-dojo.html (next: http://localhost:32962/tests/dromaeo/cssquery-ext.html) 16:04:58 INFO - PROCESS | 12311 | RSS: Main: 157278208 16:04:58 INFO - PROCESS | 12311 | 16:08:01 INFO - PROCESS | 12311 | Cycle 1(1): loaded http://localhost:32962/tests/dromaeo/cssquery-ext.html (next: http://localhost:32962/tests/dromaeo/cssquery-jquery.html) 16:08:01 INFO - PROCESS | 12311 | RSS: Main: 151203840 16:08:01 INFO - PROCESS | 12311 | 16:11:03 INFO - PROCESS | 12311 | Cycle 1(1): loaded http://localhost:32962/tests/dromaeo/cssquery-jquery.html (next: http://localhost:32962/tests/dromaeo/cssquery-mootools.html) 16:11:04 INFO - PROCESS | 12311 | RSS: Main: 152829952 16:11:04 INFO - PROCESS | 12311 | 16:14:05 INFO - PROCESS | 12311 | Cycle 1(1): loaded http://localhost:32962/tests/dromaeo/cssquery-mootools.html (next: http://localhost:32962/tests/dromaeo/cssquery-prototype.html) 16:14:06 INFO - PROCESS | 12311 | RSS: Main: 151113728 16:14:06 INFO - PROCESS | 12311 | 16:17:09 INFO - PROCESS | 12311 | Cycle 1(1): loaded http://localhost:32962/tests/dromaeo/cssquery-prototype.html (next: http://localhost:32962/tests/dromaeo/cssquery-yui.html) 16:17:09 INFO - PROCESS | 12311 | RSS: Main: 150614016 16:17:09 INFO - PROCESS | 12311 | 16:20:12 INFO - PROCESS | 12311 | Cycle 1(1): loaded http://localhost:32962/tests/dromaeo/cssquery-yui.html (next: http://localhost:32962/tests/dromaeo/cssquery-dojo.html) 16:20:12 INFO - PROCESS | 12311 | RSS: Main: 153075712 16:20:12 INFO - PROCESS | 12311 | 16:20:12 INFO - PROCESS | 12311 | __start_tp_report 16:20:12 INFO - PROCESS | 12311 | _x_x_mozilla_page_load 16:20:12 INFO - PROCESS | 12311 | _x_x_mozilla_page_load_details 16:20:12 INFO - PROCESS | 12311 | |i|pagename|runs| 16:20:12 INFO - PROCESS | 12311 | |0;dojo.html;2616.9738302616975;2617.358747106959;2647.48374067057;2664.4671065786847;2673.144593730006;4473.575010374017;4506.391637128991;4572.977135114324;4573.794179261933;4587.266037434007;4468.910621787562;4530.229860923642;4573.748443835588;4613.74624395659;4637.188492013901;4095.508538975327;4187.1416359646355;4234.06850492891;4239.851605193811;4327.7186982846015;4300.118475712487;4313.525512193672;4333.566643335673;4337.240982828008;4357.38996540483;4076.1236334188143;4145.606167414091;4179.373094035888;4208.810603522818;4243.3634954757035;4225.218334608107;4228.112096459748;4234.788260586989;4242.193983143224;4270.252705776476;4102.425660407545;4198.706090573661;4205.411242426063;4216.051388437608;4222.556631553704;4354.716943398669;4428.31361139024;4533.410656614652;4535.047639995605;4577.8397756078375;4861.51384861511;4871.56155945963;4871.610271178297;4877.804887804484;4886.413630364344;4722.811087556528;4823.807047718087;4885.218365061609;4898.926516102226;4924.581410580069;4474.194644963938;4527.683062185648;4544.613707834871;4571.748553829571;4603.447586289667;4972.602191824718;4987.600991920638;4988.950110498921;4989.476105008995;5029;4677.6257899367965;4744.739039352799;4773.498782627844;4784.68899521537;4839.1531481991215;4889.462159162489;4891.461939186686;4928.654994150375;4932.728699921467;4980.904201075758;4800.5199480051715;4819.349387832668;4841.612670986313;4842.927356089662;4850.708957462563;4578.793954272066;4677.789499472532;4753.714777113384;4826.420829500412;4827.806887724522;4023.054582173187;4025.4163146343617;4050.41269015991;4057.89855253621;4100.979495102565;3587.8385472653795;3588.085038315265;3589.4077477215965;3610.8555657773395;3632.182758879231;4134.875953721393;4227.091175397304;4243.8090285937205;4285.721428107226;4291.806868690916;4835.975820120947;4837.9032419351415;4838.709677419366;4838.95161048392;4907.944791869765;4212.91574168521;4217.641500472494;4224.070704445017;4233.5131459881895;4258.936115958263;4215.662746980234;4279.743215407086;4330.242207613655;4358.019445624709;4400.779961002001;4489.842855500042;4522.796474158671;4557.863264102082;4565.817367305403;4603.562661547147;4728.40894888139;4797.784099715452;4814.181589129927;4820.084184005028;4856.368672072608;4576.26779715244;4593.058423023205;4639;4665;4690.108879313056;4742.099001189763;4789.95210047895;4792.08950299456;4793.520647935178;4821.325014497903;4725;4806.543378379049;4851.539103785135;4855.465898751205;4905.2151655734915;4667.953320466752;4671.43942726875;4684.859454216379;4701.529847015271;4749.525047495223;4724.551167639069;4743.739094349844;4744.976275118603;4767.261074533453;4811.49479304668;4489.910201796011;4559.452865656142;4580.67935244543;4643.976780116078;4676.181668208118;4770.546798054179;4811.230203167476;4815.277708343777;4833.468318484894;4854.101991131652;4652.209124448919;4660.836870709509;4703.20045592257;4704.741239231875;4741.217699079613 16:20:12 INFO - PROCESS | 12311 | |1;ext.html;479.0562591694363;500.09982032341776;502.8214983680796;505.12108930461;526.2816255810818;23511.412214694643;31877.840610796942;32403.837980810124;32451.188720282003;32498.350032999326;35658.465123023176;35787.4631880522;35957.46063809045;36021.81989090057;36335.4549681755;7508.737194198217;7692.3076923076915;7694.5383277003275;7694.961525192366;7701.884471732928;7535.434842386816;7586.58273794941;7607.581583012932;7616.543007419545;7662.348700360476;7638.312551870331;7654.693812247503;7717.151113377552;7731.845363092735;7737.187595302496;7581.962090189541;7643.961780191119;7660.348870346055;7841.372690184829;7852.018497687789;7641.617919104078;7775.494592851446;7783.066032076131;7791.4935529190425;7796.844063118706;35793.82103089468;36057;36179.81910090433;36315.455268171;36331.818340908125;2733.6992930777596;2810.5924640927155;2924.5320748680324;3036.893708720206;3215.437298472758;24143.15498957528;24334;24554.631680524806;24764.133255336157;25164.748352516424;3242.6108866935883;3463.757536972413;3497.8251087445524;3506.66686664769;3537.00963730156;217485;217910;217915;218099;218107;42076;42176.36735448971;43124;47831.282530762066;48916.287929922284;46733;46742;46798;46883.29675054877;47039.76480117578;13796.517121900686;14079.366428510742;14119.152850828777;14171.574852754227;14218.217998010003;10581.735456613646;10588.735281618021;10599.205059620559;10663.733406664895;10711.625093121704;17250.827491725173;17497.387591434494;17533.82466175322;17619.735703964194;17627.82372176262;6615.503837212132;6791.660416979132;6828.351306625863;6851;6860.794176174722;668.7993601919502;770.7918861907253;830.4979510741339;833;841.3899922556097;24776.628350574756;25445.87277063603;25553.872230638728;25633.359166021;25646.615300770503;890.7149712092198;950.5294879034784;959.0361686505157;961.8797650293714;1047.6223765748168;13285.73428531424;13484.325783710776;14099.295035248197;14223.928880355532;14359.569212923629;208110;208253;210599;210638;211437;41230;41485.79257103695;41553.79223103865;41567.58432415637;41647.58352416498;1070.577122036791;1235.9567415140427;1236.4744983382027;1243.7450322683828;1245.4084309952882;23803.761962380155;24783.50432991294;25664.743352566235;25703.357416064748;25798.484030319665;38398.61601384062;38667.2266554673;38870.41694374643;39128.2174356517;39137;200588.9587728845;201007;202759;202924;203269;27419.588706169823;27737.583936240568;28124.29689257703;28193.43613127685;28243.71756282493;32060;32206;32329;32883.67116328806;33008.1747956303;27801.860990695724;28352.85823570869;30590.84704576463;30605.693943060283;31015.534766978966;30040.84979575088;30101.548476773303;30130.84934575313;30137.09588712342;30572.694273057874;30379.544306835858;30838.69161308358;30893.38213235678;31000.22499437532;31011.379772404878;26621.600675990263;27422.314442139104;27897.721022789512;27983.720162798112;28026.719732802412;22308.330750077523;22355.44111397228;22453.21413750576;22503.549929001656;22672.65991010169 16:20:12 INFO - PROCESS | 12311 | |2;jquery.html;344.12592016278654;345.31799695601177;348.75412833952066;348.76109864742654;352.0529774905504;13950.302484875767;14169.362378692958;15119.319630616621;15293.84706152938;15750.448734294274;9757.658481953133;9985.650502232424;12169.634910952664;14872.256387180652;14964.401423943056;4430.734155950645;4578.885527861814;4587.495375508692;4798;4967.031428871372;4849.296851956464;4882.584980276681;4925.655204135712;4937.77779999899;4947.381577302837;4795.616350691954;4972.0801651694555;4972.726500042496;5136.614753893455;5139.820106296281;4883.218685010399;4898.167311557044;4931.309616653672;4947.134251505972;5726.713664316768;5134.486551344873;5136.845894623168;5143.3570803649545;5149.639525233235;5154.433012368637;10856.294340867818;16588.75116873248;17657.558561036076;18255.178516966636;18402.171902264432;1761.8150094240177;1857.990710046441;1876.587150826816;1912.741779859715;1937.060525645061;8192.467489613156;8297.709580164727;8301.211384918422;8740.431871928367;9929.156021738161;1693.09419460588;1708.6241026974046;1717.2186655072037;1738.5219064757166;1761.6476704658992;46645.76677116593;47586.28620570694;48049.75975120137;49754;51097.744511277575;8655.52394618302;9081.68214112503;9304.627814887464;9373.39072960269;9497.192738617296;11433.028192603555;11500.48247828833;11531.365774882463;11535.250208736405;11542.07663386927;6555.246146693096;6816.113905192294;6897.827554311182;6919.861602767916;6956.65216739161;6214.4407003369915;6222.719977600928;6360.236771587439;6423.4861211103;6470.4823614110755;4033;4105.8973525662095;4115.938260926088;4135.8966025849595;4148.211839750437;1593.306911493504;1776.7157254839165;1781.2162648434648;1812.6555954368628;1825.4797382745853;336.9655158662881;341.2833050593783;344.9862005519751;346.73821264944803;768.5849641193693;14207.857921420653;14983.925080374747;15027.248637568078;15549.455769048256;16065.518034458984;822.3585603229491;842.9662813487391;867.4318321499428;872.097379212512;874.3617159473492;8570.785730356667;8576.957115214509;8647.351448641251;8694.478331300143;8770.736877893672;423558;424638;428359;445167;458575;60174;61477.38522614806;62368.37631623716;64116.679416602616;65646.67176664087;1001.6794625719846;1030.9123724483502;1035.6219979707353;1037.159900480613;1046.0533217438078;13493.730125397633;13636.181829090287;13685.75448259358;13804.861951380759;13971.860281397463;29549;29653;29787.55318670265;30100.54849177308;30159.944401945828;37188.44217336796;38004.239915202095;38056;38146.237075257784;39057.6094239054;5918.437748413894;6064.878702426015;6117.877642447215;6121.081837724377;6165.32181460048;6694.564853284521;8793.648254070022;9136.223421009023;9316.44101353921;9385;7527.661255243636;7876.921230787619;7881.487703299267;7946.443748937751;8160.26557609818;3878.7478813877005;7645.5794931279315;8205.425620206528;8378.204070613281;8503.362247831561;8273.875891861748;8413.537255451009;8434.746957591282;8565.914340856762;8711.041785403473;6021.54838387114;6167.784127555514;6182.28903676083;6241.719122639583;6253;7517.774466766005;8105.918940810752;8146.906870471909;8191.098979112412;8209.343252539902 16:20:12 INFO - PROCESS | 12311 | |3;mootools.html;1381.509564104743;1403.8806701430378;1497.7378958682234;1663.7005339038967;1676.8993860368387;5767.913481297774;5884.323302820167;6501.4473769729575;6645.700943457544;6649.035889795977;6473.514486413526;6670.266270710218;6712.261651218374;6713.832154196148;6736.932630673692;2010.3968809357207;2028.1177687705822;2037.684158955357;2038.1949130093603;2039.255671679841;1978.1889425335614;1992.5915187386624;1996.131682718015;2027;2030.5735795482892;2009.2063634864219;2016.5563576013253;2019.121682068305;2027.6654352031971;2030.0560239488634;2061.1858315965183;2067.7415323084615;2070.0581235537793;2070.6479898417306;2070.8446866485074;2014.74815648044;2029.6042271757012;2034.104993802722;2035.3486884197064;2037.0425899827057;6953.130858642669;6959.6868140933775;6975.930240697629;6985.755498557577;6988.860222795566;3905.0627849316243;3929.6659783918403;3973.6225058619384;3980.960190398088;3985.8405663773415;2569.473257982128;2583.8760139339447;2618.1883616078885;2663.840169589831;2664.0542607374296;829.713748756678;843.0978852627691;857.5455008845322;858.9312854971587;1703.7529558214114;8786.956065219632;8851.513166775825;8857.468551886843;8887.60005799734;8889.333300002461;3380.509826075205;3434.9313013739584;3468.514407982884;3482.094655389617;3517.683408493248;7286.854262914712;7288.052553168161;7292.270772922665;7295;7295.52579082358;3891.6886649068006;3912.8043597820565;3917.9608203918165;3973.662238709684;3983.083890705096;3513.209527856212;3611.422172452395;3618.4029635109914;3649.616790236987;3674.8346324415465;2927.2535503446484;2993.027266138514;2998.835064071497;3003.414334204809;3007.8195308281574;891.3225948279354;894.0478390514081;902.1474706402387;904.9638014479347;919.5540163020929;834;839.341117222977;843.9156084391634;846.2341580869323;1023.2172388123092;6393.456556192683;6420.839479013062;6422.8715425691225;6423.935760642427;6425.807225783234;387.18111194822745;387.67822707152993;387.7285899870102;390.09303369665076;394.5482422626077;5016.54851063406;5119.897602047939;5123.923141152885;5146.279520867081;5152.92270615941;7474.177840437547;7641.579713115832;8168.714095006765;8305.916940830515;8311.625976831057;7830.92169078302;8001.199880011952;8007.279344858991;8009.719659811879;8060.15368386311;6428.19647544057;6460.676966151674;6508.674566271668;6536.542442029107;6560.475161987029;6498.220213574401;6572.145621069421;6577.80266592003;6587.242467116152;6607.768728094494;7359.632018399166;7390.482666213314;7469.402447804054;7523.0972283326355;7599.126100498514;7479.588622625808;7678.846423071395;7688.884666730115;7720.729774457867;7732.536047837148;5356.732163391893;5490.862728431821;6124.8775024500155;6197.597156184834;6221.377862213742;6411.230652321751;6520.771772987922;6547.672616369067;6557.180352455943;6561.278259391368;6003.234800900933;6255.280642726145;6267.1539342188225;6311.936880631135;6394.712237949397;5970.9701451492465;5983.611065280743;6053.878922421615;6054.6064505808745;6174.753009879554;6043.305019922589;6086.817395478142;6099.390060994043;6123.418275263843;6150.415710507495;5718.771249149988;5720.656760594377;5749.942500574941;5759.366469688247;5769.278840144982;5580.051391263414;5640.407757185437;5647.745851436777;5761.308642962871;5763.106718458645 16:20:12 INFO - PROCESS | 12311 | |4;prototype.html;272.6727926488214;276.0999142794489;278.5139930820716;279.9230211691785;280.6379770096577;5374.113271310239;5488.670679759217;5590.4130066343005;5640.661560306379;5662.094064949614;5540.252065971093;5644.350899646542;5650.29371328584;5651.8304450866535;5667.801626943058;4267.445232119836;4272.295071313238;4281.229378711831;4281.8287268509375;4286.03564198056;4279.144171165779;4286.164197981395;4293.22721910056;4307.095509942916;4313.805878735465;4227.112306415641;4244.363345498169;4249.128928569636;4254.978725106385;4258.488981322245;4005.158916627497;4144.233316836395;4145.17096580682;4191.098913733562;4200.579942005806;3579.7494175407733;3581.6955558777536;3581.7850928944345;3582.42681171014;3587.336342776595;5373.596980226499;5382.946170538284;5393.056215162331;5395.649282796606;5397.190421436777;4739.834105806281;4781.976090119562;4783.115123702126;4797.784099715521;4798.592119669832;5594.580406469531;5638.069718496443;5807.216025836543;5824;5864.354920958691;3835.7314987950854;3840.539135303781;3841.615838416164;3848.942265866014;3849.9230015399535;6081.391860813883;6149.815505534841;6161.907571386388;6171.25944886612;6178.5366097542865;3915.099527108781;3949.407588861636;3953.2291203215095;3955.7428767130045;3969.8884312392574;3864.632859878307;4022.1754540319166;4028.576999415078;4028.818703158306;4048.27131116396;4728.290756386569;4737.123632128068;4738.620910327166;4742.810287588458;4750.14497390473;5909.29088509373;5920.259967504062;5932.970335148297;5935.73289201987;5939.613925094855;1404.206623257856;1427.4789701758991;1429.106808244847;1433.4982756035304;1433.8781203597812;914.2594498456272;925.4632313258294;926.1895841139003;946.4888959961544;950.5579905344048;5140.254663073833;5148.9485105149215;5157.742112894341;5160.329157209614;5173.379194496684;6106.755729770848;6118.326984031842;6121.816345509642;6124.969375153096;6125;5121.948780512222;5136.5890728741615;5137.640365174477;5144.408393034774;5168.069747445421;3230.095573239497;3290.177455636091;3318.900432987014;3319.7012268895915;3324.517944897976;5784.305883294031;5792.0732682771395;5811.941880581225;5813.593048486566;5813.651180929158;6356.459700925473;6375.139356186948;6375.840603984938;6396.232452105777;6402.135711678957;5618.185363122406;5782.826515204551;5785.681787501728;5813.6221145625395;5828.154917536934;5878.676672782867;6026.337102918763;6069.362716914837;6179.16581261524;6201.937980620136;6043.54673399488;6048.90926636092;6054.66699331541;6062.908676438284;6065.939340606537;5768.423157684198;5778.757567123089;5784.537237021113;5787.189793429007;5787.508061814793;3855.383138697795;3943.309920763912;3970.4639873616693;3991.5409727881665;3997.440358349775;6083.513318934386;6084.787032453843;6114.144019837316;6123.479504242189;6127.662978536223;5877.23595932526;5882.352941176381;5888.381719919346;5888.941110588839;5900.262467191601;5717.828465146053;5883.235179426647;5885.440883116097;5900.11498275245;5908.291005079418;5768.394318596487;5772.393898640582;5782.595218334676;5809.535237180931;5825.621334613236;5953.404659534185;5969.611975221596;5975.073863551156;5979.611325263844;5981;5741.368449470639;5787.913181302368;5875.118732190205;5880.647161170344;5882.441168089024 16:20:12 INFO - PROCESS | 12311 | |5;yui.html;682.1916029505034;706.3819158236543;758.6434375843352;782.2881178127903;812.874004529298;11207.775844483105;11304.095672346213;11340.206185567014;11371.147163962705;11414.143939204552;12624.305663188521;12644.178128421669;12692.682682932931;12776;12843.35783210838;745.955242685438;751.7030772844723;769.1692971590696;774.2335088262607;774.5391492062242;761.8819083042109;762.1235579084042;766.643510767493;766.8274638206386;769.2499812682618;794.9920500794976;795.8448102619991;797.7766225456852;798.6925033861976;801.6312496251702;772.6986475274647;780.5706861226303;782.5226611766818;784.2040329066002;784.7802615267734;584.4214227914376;585.4058130996999;585.7598384662268;586.5864565481326;587.6151121015741;11972.461239244254;12030.759384812342;12041.518339266418;12043.578474753429;12081.27512349253;10963.342199467977;11312.377819219939;11401.201915865893;11411;11730.061595072373;9431.386959847589;9500.477473738942;9523.571439285179;9532.52337383128;9554.48041021953;3277.3936821687826;3287.4411350070545;3310.3710295043866;3334.4664853623544;3348.41402754517;35110;35318.47022294668;35403.82298088519;35418.46872296918;35507.822460887786;9066.184043436122;9126.13301736334;9170.49562274068;9214.433546297145;9350.95324523373;15364;15408.691826163415;15503.224838758017;15541;15541.222938853012;6536.640484773288;6596.835079122964;6606.900896486556;6648.800535983928;6771.864562708718;3476.704480119168;3483.8155027290336;3497.982510087433;3526.3123690880034;3541.7520773545602;2496.6379874918034;2549.107812265729;2552.3874270175024;2552.7447255274697;2558.8976440942156;452.5949275398566;456.6095987930272;457.77340216593;458.6055991847009;460.69363873024065;402.89204687110447;432.4464685202945;537.4437457231746;569.3822202909806;587.1896782440206;7260.92739072613;7434.368078713262;7439.925600744032;7585;7764.8058798529355;441.17720451357985;517.9559737422361;581.7149596697587;582.6387639663351;612.4579746923915;3437.9312413751586;3453.620101788801;3526.4710293456187;3718.5909549949483;3752.512173417438;46861.53138468572;47333.76333118312;47592.7620361896;51760.74119629378;51895.962080758174;40913;42207.788961055;42247.366289505684;42565.574344256784;43301.566984330384;36116;36270.4559431614;36958.445623315674;39100;39592.60407395889;7417.740379086706;7893.289603935674;7961.8407631848195;8167.264946154874;8340.249377556049;28634.284142896595;28676.713232867405;29234.41531169322;29319.120426387242;29443.411131777673;34797;35154.64845351616;35540.822295888356;36236.63763362333;38530.80734596309;9832.655857044969;9835;9937.950310248403;10179.083882450319;10187.134093602126;10986.780264394827;11035.062019728091;11133.665990020312;11134.721631959266;11780.293182409083;10427.791444171226;10727.302725322828;10733.141348692243;10924.726881828017;11129.276597021168;8973.192412682889;9075.410098343587;9300.906990930003;9465.432074075577;9534.761630959281;9957.352772069793;10336.896631033593;10661.733456663645;10710.196735245043;10743.409112498888;8059.3552515799765;8127.75902363015;8203.548804815793;8363.874541881754;8477.38221300827;8437.114103019094;8575.356848236532;8625.741227763177;8981.865272020794;9019.188273055457 16:20:12 INFO - PROCESS | 12311 | __end_tp_report 16:20:12 INFO - PROCESS | 12311 | __start_cc_report 16:20:12 INFO - PROCESS | 12311 | _x_x_mozilla_cycle_collect,333 16:20:12 INFO - PROCESS | 12311 | __end_cc_report 16:20:12 INFO - PROCESS | 12311 | __startTimestamp1452903612619__endTimestamp 16:20:12 INFO - PROCESS | 12311 | 16:20:12 INFO - PROCESS | 12311 | ------- Summary: start ------- 16:20:12 INFO - PROCESS | 12311 | Number of tests: 6 16:20:12 INFO - PROCESS | 12311 | 16:20:12 INFO - PROCESS | 12311 | [#0] dojo.html Cycles:165 Average:4495.12 Median:4603.45 stddev:451.57 (9.8%) stddev-sans-first:428.25 16:20:12 INFO - PROCESS | 12311 | Values: 2617.0 2617.4 2647.5 2664.5 2673.1 4473.6 4506.4 4573.0 4573.8 4587.3 4468.9 4530.2 4573.7 4613.7 4637.2 4095.5 4187.1 4234.1 4239.9 4327.7 4300.1 4313.5 4333.6 4337.2 4357.4 4076.1 4145.6 4179.4 4208.8 4243.4 4225.2 4228.1 4234.8 4242.2 4270.3 4102.4 4198.7 4205.4 4216.1 4222.6 4354.7 4428.3 4533.4 4535.0 4577.8 4861.5 4871.6 4871.6 4877.8 4886.4 4722.8 4823.8 4885.2 4898.9 4924.6 4474.2 4527.7 4544.6 4571.7 4603.4 4972.6 4987.6 4989.0 4989.5 5029.0 4677.6 4744.7 4773.5 4784.7 4839.2 4889.5 4891.5 4928.7 4932.7 4980.9 4800.5 4819.3 4841.6 4842.9 4850.7 4578.8 4677.8 4753.7 4826.4 4827.8 4023.1 4025.4 4050.4 4057.9 4101.0 3587.8 3588.1 3589.4 3610.9 3632.2 4134.9 4227.1 4243.8 4285.7 4291.8 4836.0 4837.9 4838.7 4839.0 4907.9 4212.9 4217.6 4224.1 4233.5 4258.9 4215.7 4279.7 4330.2 4358.0 4400.8 4489.8 4522.8 4557.9 4565.8 4603.6 4728.4 4797.8 4814.2 4820.1 4856.4 4576.3 4593.1 4639.0 4665.0 4690.1 4742.1 4790.0 4792.1 4793.5 4821.3 4725.0 4806.5 4851.5 4855.5 4905.2 4668.0 4671.4 4684.9 4701.5 4749.5 4724.6 4743.7 4745.0 4767.3 4811.5 4489.9 4559.5 4580.7 4644.0 4676.2 4770.5 4811.2 4815.3 4833.5 4854.1 4652.2 4660.8 4703.2 4704.7 4741.2 16:20:12 INFO - PROCESS | 12311 | 16:20:12 INFO - PROCESS | 12311 | [#1] ext.html Cycles:180 Average:35888.11 Median:31446.69 stddev:54383.27 (172.9%) stddev-sans-first:54470.84 16:20:12 INFO - PROCESS | 12311 | Values: 479.1 500.1 502.8 505.1 526.3 23511.4 31877.8 32403.8 32451.2 32498.4 35658.5 35787.5 35957.5 36021.8 36335.5 7508.7 7692.3 7694.5 7695.0 7701.9 7535.4 7586.6 7607.6 7616.5 7662.3 7638.3 7654.7 7717.2 7731.8 7737.2 7582.0 7644.0 7660.3 7841.4 7852.0 7641.6 7775.5 7783.1 7791.5 7796.8 35793.8 36057.0 36179.8 36315.5 36331.8 2733.7 2810.6 2924.5 3036.9 3215.4 24143.2 24334.0 24554.6 24764.1 25164.7 3242.6 3463.8 3497.8 3506.7 3537.0 217485.0 217910.0 217915.0 218099.0 218107.0 42076.0 42176.4 43124.0 47831.3 48916.3 46733.0 46742.0 46798.0 46883.3 47039.8 13796.5 14079.4 14119.2 14171.6 14218.2 10581.7 10588.7 10599.2 10663.7 10711.6 17250.8 17497.4 17533.8 17619.7 17627.8 6615.5 6791.7 6828.4 6851.0 6860.8 668.8 770.8 830.5 833.0 841.4 24776.6 25445.9 25553.9 25633.4 25646.6 890.7 950.5 959.0 961.9 1047.6 13285.7 13484.3 14099.3 14223.9 14359.6 208110.0 208253.0 210599.0 210638.0 211437.0 41230.0 41485.8 41553.8 41567.6 41647.6 1070.6 1236.0 1236.5 1243.7 1245.4 23803.8 24783.5 25664.7 25703.4 25798.5 38398.6 38667.2 38870.4 39128.2 39137.0 200589.0 201007.0 202759.0 202924.0 203269.0 27419.6 27737.6 28124.3 28193.4 28243.7 32060.0 32206.0 32329.0 32883.7 33008.2 27801.9 28352.9 30590.8 30605.7 31015.5 30040.8 30101.5 30130.8 30137.1 30572.7 30379.5 30838.7 30893.4 31000.2 31011.4 26621.6 27422.3 27897.7 27983.7 28026.7 22308.3 22355.4 22453.2 22503.5 22672.7 16:20:12 INFO - PROCESS | 12311 | 16:20:12 INFO - PROCESS | 12311 | [#2] jquery.html Cycles:180 Average:23016.29 Median:4928.48 stddev:71301.02 (1446.7%) stddev-sans-first:71480.71 16:20:12 INFO - PROCESS | 12311 | Values: 344.1 345.3 348.8 348.8 352.1 13950.3 14169.4 15119.3 15293.8 15750.4 9757.7 9985.7 12169.6 14872.3 14964.4 4430.7 4578.9 4587.5 4798.0 4967.0 4849.3 4882.6 4925.7 4937.8 4947.4 4795.6 4972.1 4972.7 5136.6 5139.8 4883.2 4898.2 4931.3 4947.1 5726.7 5134.5 5136.8 5143.4 5149.6 5154.4 10856.3 16588.8 17657.6 18255.2 18402.2 1761.8 1858.0 1876.6 1912.7 1937.1 8192.5 8297.7 8301.2 8740.4 9929.2 1693.1 1708.6 1717.2 1738.5 1761.6 46645.8 47586.3 48049.8 49754.0 51097.7 8655.5 9081.7 9304.6 9373.4 9497.2 11433.0 11500.5 11531.4 11535.3 11542.1 6555.2 6816.1 6897.8 6919.9 6956.7 6214.4 6222.7 6360.2 6423.5 6470.5 4033.0 4105.9 4115.9 4135.9 4148.2 1593.3 1776.7 1781.2 1812.7 1825.5 337.0 341.3 345.0 346.7 768.6 14207.9 14983.9 15027.2 15549.5 16065.5 822.4 843.0 867.4 872.1 874.4 8570.8 8577.0 8647.4 8694.5 8770.7 423558.0 424638.0 428359.0 445167.0 458575.0 60174.0 61477.4 62368.4 64116.7 65646.7 1001.7 1030.9 1035.6 1037.2 1046.1 13493.7 13636.2 13685.8 13804.9 13971.9 29549.0 29653.0 29787.6 30100.5 30159.9 37188.4 38004.2 38056.0 38146.2 39057.6 5918.4 6064.9 6117.9 6121.1 6165.3 6694.6 8793.6 9136.2 9316.4 9385.0 7527.7 7876.9 7881.5 7946.4 8160.3 3878.7 7645.6 8205.4 8378.2 8503.4 8273.9 8413.5 8434.7 8565.9 8711.0 6021.5 6167.8 6182.3 6241.7 6253.0 7517.8 8105.9 8146.9 8191.1 8209.3 16:20:12 INFO - PROCESS | 12311 | 16:20:12 INFO - PROCESS | 12311 | [#3] mootools.html Cycles:180 Average:4705.73 Median:6054.24 stddev:2449.89 (40.5%) stddev-sans-first:2444.03 16:20:12 INFO - PROCESS | 12311 | Values: 1381.5 1403.9 1497.7 1663.7 1676.9 5767.9 5884.3 6501.4 6645.7 6649.0 6473.5 6670.3 6712.3 6713.8 6736.9 2010.4 2028.1 2037.7 2038.2 2039.3 1978.2 1992.6 1996.1 2027.0 2030.6 2009.2 2016.6 2019.1 2027.7 2030.1 2061.2 2067.7 2070.1 2070.6 2070.8 2014.7 2029.6 2034.1 2035.3 2037.0 6953.1 6959.7 6975.9 6985.8 6988.9 3905.1 3929.7 3973.6 3981.0 3985.8 2569.5 2583.9 2618.2 2663.8 2664.1 829.7 843.1 857.5 858.9 1703.8 8787.0 8851.5 8857.5 8887.6 8889.3 3380.5 3434.9 3468.5 3482.1 3517.7 7286.9 7288.1 7292.3 7295.0 7295.5 3891.7 3912.8 3918.0 3973.7 3983.1 3513.2 3611.4 3618.4 3649.6 3674.8 2927.3 2993.0 2998.8 3003.4 3007.8 891.3 894.0 902.1 905.0 919.6 834.0 839.3 843.9 846.2 1023.2 6393.5 6420.8 6422.9 6423.9 6425.8 387.2 387.7 387.7 390.1 394.5 5016.5 5119.9 5123.9 5146.3 5152.9 7474.2 7641.6 8168.7 8305.9 8311.6 7830.9 8001.2 8007.3 8009.7 8060.2 6428.2 6460.7 6508.7 6536.5 6560.5 6498.2 6572.1 6577.8 6587.2 6607.8 7359.6 7390.5 7469.4 7523.1 7599.1 7479.6 7678.8 7688.9 7720.7 7732.5 5356.7 5490.9 6124.9 6197.6 6221.4 6411.2 6520.8 6547.7 6557.2 6561.3 6003.2 6255.3 6267.2 6311.9 6394.7 5971.0 5983.6 6053.9 6054.6 6174.8 6043.3 6086.8 6099.4 6123.4 6150.4 5718.8 5720.7 5749.9 5759.4 5769.3 5580.1 5640.4 5647.7 5761.3 5763.1 16:20:12 INFO - PROCESS | 12311 | 16:20:12 INFO - PROCESS | 12311 | [#4] prototype.html Cycles:180 Average:4829.22 Median:5628.13 stddev:1480.37 (26.3%) stddev-sans-first:1444.47 16:20:12 INFO - PROCESS | 12311 | Values: 272.7 276.1 278.5 279.9 280.6 5374.1 5488.7 5590.4 5640.7 5662.1 5540.3 5644.4 5650.3 5651.8 5667.8 4267.4 4272.3 4281.2 4281.8 4286.0 4279.1 4286.2 4293.2 4307.1 4313.8 4227.1 4244.4 4249.1 4255.0 4258.5 4005.2 4144.2 4145.2 4191.1 4200.6 3579.7 3581.7 3581.8 3582.4 3587.3 5373.6 5382.9 5393.1 5395.6 5397.2 4739.8 4782.0 4783.1 4797.8 4798.6 5594.6 5638.1 5807.2 5824.0 5864.4 3835.7 3840.5 3841.6 3848.9 3849.9 6081.4 6149.8 6161.9 6171.3 6178.5 3915.1 3949.4 3953.2 3955.7 3969.9 3864.6 4022.2 4028.6 4028.8 4048.3 4728.3 4737.1 4738.6 4742.8 4750.1 5909.3 5920.3 5933.0 5935.7 5939.6 1404.2 1427.5 1429.1 1433.5 1433.9 914.3 925.5 926.2 946.5 950.6 5140.3 5148.9 5157.7 5160.3 5173.4 6106.8 6118.3 6121.8 6125.0 6125.0 5121.9 5136.6 5137.6 5144.4 5168.1 3230.1 3290.2 3318.9 3319.7 3324.5 5784.3 5792.1 5811.9 5813.6 5813.7 6356.5 6375.1 6375.8 6396.2 6402.1 5618.2 5782.8 5785.7 5813.6 5828.2 5878.7 6026.3 6069.4 6179.2 6201.9 6043.5 6048.9 6054.7 6062.9 6065.9 5768.4 5778.8 5784.5 5787.2 5787.5 3855.4 3943.3 3970.5 3991.5 3997.4 6083.5 6084.8 6114.1 6123.5 6127.7 5877.2 5882.4 5888.4 5888.9 5900.3 5717.8 5883.2 5885.4 5900.1 5908.3 5768.4 5772.4 5782.6 5809.5 5825.6 5953.4 5969.6 5975.1 5979.6 5981.0 5741.4 5787.9 5875.1 5880.6 5882.4 16:20:12 INFO - PROCESS | 12311 | 16:20:12 INFO - PROCESS | 12311 | [#5] yui.html Cycles:180 Average:11686.46 Median:457.19 stddev:12910.10 (2823.8%) stddev-sans-first:12919.87 16:20:12 INFO - PROCESS | 12311 | Values: 682.2 706.4 758.6 782.3 812.9 11207.8 11304.1 11340.2 11371.1 11414.1 12624.3 12644.2 12692.7 12776.0 12843.4 746.0 751.7 769.2 774.2 774.5 761.9 762.1 766.6 766.8 769.2 795.0 795.8 797.8 798.7 801.6 772.7 780.6 782.5 784.2 784.8 584.4 585.4 585.8 586.6 587.6 11972.5 12030.8 12041.5 12043.6 12081.3 10963.3 11312.4 11401.2 11411.0 11730.1 9431.4 9500.5 9523.6 9532.5 9554.5 3277.4 3287.4 3310.4 3334.5 3348.4 35110.0 35318.5 35403.8 35418.5 35507.8 9066.2 9126.1 9170.5 9214.4 9351.0 15364.0 15408.7 15503.2 15541.0 15541.2 6536.6 6596.8 6606.9 6648.8 6771.9 3476.7 3483.8 3498.0 3526.3 3541.8 2496.6 2549.1 2552.4 2552.7 2558.9 452.6 456.6 457.8 458.6 460.7 402.9 432.4 537.4 569.4 587.2 7260.9 7434.4 7439.9 7585.0 7764.8 441.2 518.0 581.7 582.6 612.5 3437.9 3453.6 3526.5 3718.6 3752.5 46861.5 47333.8 47592.8 51760.7 51896.0 40913.0 42207.8 42247.4 42565.6 43301.6 36116.0 36270.5 36958.4 39100.0 39592.6 7417.7 7893.3 7961.8 8167.3 8340.2 28634.3 28676.7 29234.4 29319.1 29443.4 34797.0 35154.6 35540.8 36236.6 38530.8 9832.7 9835.0 9938.0 10179.1 10187.1 10986.8 11035.1 11133.7 11134.7 11780.3 10427.8 10727.3 10733.1 10924.7 11129.3 8973.2 9075.4 9300.9 9465.4 9534.8 9957.4 10336.9 10661.7 10710.2 10743.4 8059.4 8127.8 8203.5 8363.9 8477.4 8437.1 8575.4 8625.7 8981.9 9019.2 16:20:12 INFO - PROCESS | 12311 | -------- Summary: end -------- 16:20:12 INFO - PROCESS | 12311 | 16:20:13 INFO - TEST-INFO | 12311: exit 0 16:20:13 INFO - TEST-OK | dromaeo_css | took 1115016ms 16:20:13 INFO - TEST-START | kraken 16:20:13 INFO - operating with platform_type : linux_ 16:20:13 INFO - Initialising browser for kraken test... 16:20:13 INFO - TEST-INFO | started process 12552 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpa0WjJO/profile http://localhost:32962/getInfo.html) 16:20:17 INFO - PROCESS | 12552 | 16:20:17 INFO - PROCESS | 12552 | (process:12623): GLib-CRITICAL **: g_path_get_basename: assertion `file_name != NULL' failed 16:20:18 INFO - PROCESS | 12552 | __metrics Screen width/height:1600/1200 16:20:18 INFO - PROCESS | 12552 | colorDepth:24 16:20:18 INFO - PROCESS | 12552 | Browser inner width/height: 1024/697 16:20:18 INFO - PROCESS | 12552 | __metrics 16:20:18 INFO - PROCESS | 12552 | JavaScript error: resource://gre/modules/PerformanceStats.jsm, line 211: NS_ERROR_NOT_AVAILABLE: Component returned failure code: 0x80040111 (NS_ERROR_NOT_AVAILABLE) [nsIPerformanceStatsService.isMonitoringJank] 16:20:19 INFO - TEST-INFO | 12552: exit 0 16:20:19 INFO - Browser initialized. 16:20:19 INFO - Running cycle 1/1 for kraken test... 16:20:19 INFO - TEST-INFO | started process 12672 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpa0WjJO/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 16:20:20 INFO - PROCESS | 12672 | 16:20:20 INFO - PROCESS | 12672 | (process:12728): GLib-CRITICAL **: g_path_get_basename: assertion `file_name != NULL' failed 16:20:31 INFO - PROCESS | 12672 | RSS: Main: 150671360 16:20:31 INFO - PROCESS | 12672 | 16:20:34 INFO - PROCESS | 12672 | Cycle 1(1): loaded http://localhost:32962/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:32962/tests/kraken/driver.html?testName=audio-beat-detection) 16:20:34 INFO - PROCESS | 12672 | RSS: Main: 151076864 16:20:34 INFO - PROCESS | 12672 | 16:20:37 INFO - PROCESS | 12672 | Cycle 1(1): loaded http://localhost:32962/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:32962/tests/kraken/driver.html?testName=audio-dft) 16:20:38 INFO - PROCESS | 12672 | RSS: Main: 153960448 16:20:38 INFO - PROCESS | 12672 | 16:20:40 INFO - PROCESS | 12672 | Cycle 1(1): loaded http://localhost:32962/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:32962/tests/kraken/driver.html?testName=audio-fft) 16:20:41 INFO - PROCESS | 12672 | RSS: Main: 149147648 16:20:41 INFO - PROCESS | 12672 | 16:20:43 INFO - PROCESS | 12672 | Cycle 1(1): loaded http://localhost:32962/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:32962/tests/kraken/driver.html?testName=audio-oscillator) 16:20:44 INFO - PROCESS | 12672 | RSS: Main: 148664320 16:20:44 INFO - PROCESS | 12672 | 16:20:46 INFO - PROCESS | 12672 | Cycle 1(1): loaded http://localhost:32962/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:32962/tests/kraken/driver.html?testName=imaging-gaussian-blur) 16:20:47 INFO - PROCESS | 12672 | RSS: Main: 150290432 16:20:47 INFO - PROCESS | 12672 | 16:20:50 INFO - PROCESS | 12672 | Cycle 1(1): loaded http://localhost:32962/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:32962/tests/kraken/driver.html?testName=imaging-darkroom) 16:20:50 INFO - PROCESS | 12672 | RSS: Main: 148672512 16:20:50 INFO - PROCESS | 12672 | 16:20:54 INFO - PROCESS | 12672 | Cycle 1(1): loaded http://localhost:32962/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:32962/tests/kraken/driver.html?testName=imaging-desaturate) 16:20:54 INFO - PROCESS | 12672 | RSS: Main: 146923520 16:20:54 INFO - PROCESS | 12672 | 16:20:57 INFO - PROCESS | 12672 | Cycle 1(1): loaded http://localhost:32962/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:32962/tests/kraken/driver.html?testName=json-parse-financial) 16:20:58 INFO - PROCESS | 12672 | RSS: Main: 147091456 16:20:58 INFO - PROCESS | 12672 | 16:21:00 INFO - PROCESS | 12672 | Cycle 1(1): loaded http://localhost:32962/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:32962/tests/kraken/driver.html?testName=json-stringify-tinderbox) 16:21:00 INFO - PROCESS | 12672 | RSS: Main: 148164608 16:21:00 INFO - PROCESS | 12672 | 16:21:02 INFO - PROCESS | 12672 | Cycle 1(1): loaded http://localhost:32962/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:32962/tests/kraken/driver.html?testName=stanford-crypto-aes) 16:21:03 INFO - PROCESS | 12672 | RSS: Main: 148148224 16:21:03 INFO - PROCESS | 12672 | 16:21:05 INFO - PROCESS | 12672 | Cycle 1(1): loaded http://localhost:32962/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:32962/tests/kraken/driver.html?testName=stanford-crypto-ccm) 16:21:05 INFO - PROCESS | 12672 | RSS: Main: 147742720 16:21:05 INFO - PROCESS | 12672 | 16:21:08 INFO - PROCESS | 12672 | Cycle 1(1): loaded http://localhost:32962/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:32962/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 16:21:09 INFO - PROCESS | 12672 | RSS: Main: 147562496 16:21:09 INFO - PROCESS | 12672 | 16:21:11 INFO - PROCESS | 12672 | Cycle 1(1): loaded http://localhost:32962/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:32962/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 16:21:12 INFO - PROCESS | 12672 | RSS: Main: 148447232 16:21:12 INFO - PROCESS | 12672 | 16:21:14 INFO - PROCESS | 12672 | Cycle 1(1): loaded http://localhost:32962/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:32962/tests/kraken/driver.html?testName=ai-astar) 16:21:14 INFO - PROCESS | 12672 | RSS: Main: 149532672 16:21:14 INFO - PROCESS | 12672 | 16:21:14 INFO - PROCESS | 12672 | __start_tp_report 16:21:14 INFO - PROCESS | 12672 | _x_x_mozilla_page_load 16:21:14 INFO - PROCESS | 12672 | _x_x_mozilla_page_load_details 16:21:14 INFO - PROCESS | 12672 | |i|pagename|runs| 16:21:14 INFO - PROCESS | 12672 | |0;ai-astar;115;109;115;114;113;126;114;114;114;113 16:21:14 INFO - PROCESS | 12672 | |1;audio-beat-detection;155;135;157;171;134;150;162;135;187;139 16:21:14 INFO - PROCESS | 12672 | |2;audio-dft;163;161;164;165;163;164;170;166;168;162 16:21:14 INFO - PROCESS | 12672 | |3;audio-fft;75;71;76;72;131;73;73;73;73;88 16:21:14 INFO - PROCESS | 12672 | |4;audio-oscillator;98;97;138;97;98;97;141;97;97;136 16:21:14 INFO - PROCESS | 12672 | |5;imaging-gaussian-blur;112;111;110;111;109;110;110;110;109;112 16:21:14 INFO - PROCESS | 12672 | |6;imaging-darkroom;148;148;147;147;148;149;148;150;149;148 16:21:14 INFO - PROCESS | 12672 | |7;imaging-desaturate;96;96;97;96;96;96;96;97;97;96 16:21:14 INFO - PROCESS | 12672 | |8;json-parse-financial;70;70;69;69;70;68;71;69;70;70 16:21:14 INFO - PROCESS | 12672 | |9;json-stringify-tinderbox;68;68;72;69;71;69;69;69;69;68 16:21:14 INFO - PROCESS | 12672 | |10;stanford-crypto-aes;82;85;83;85;86;84;85;84;86;84 16:21:14 INFO - PROCESS | 12672 | |11;stanford-crypto-ccm;123;120;124;131;123;130;124;131;124;119 16:21:14 INFO - PROCESS | 12672 | |12;stanford-crypto-pbkdf2;145;157;164;148;151;137;154;164;151;141 16:21:14 INFO - PROCESS | 12672 | |13;stanford-crypto-sha256-iterative;72;72;72;71;76;69;77;73;71;74 16:21:14 INFO - PROCESS | 12672 | __end_tp_report 16:21:14 INFO - PROCESS | 12672 | __start_cc_report 16:21:14 INFO - PROCESS | 12672 | _x_x_mozilla_cycle_collect,812 16:21:14 INFO - PROCESS | 12672 | __end_cc_report 16:21:14 INFO - PROCESS | 12672 | __startTimestamp1452903674373__endTimestamp 16:21:14 INFO - PROCESS | 12672 | 16:21:14 INFO - PROCESS | 12672 | ------- Summary: start ------- 16:21:14 INFO - PROCESS | 12672 | Number of tests: 14 16:21:14 INFO - PROCESS | 12672 | 16:21:14 INFO - PROCESS | 12672 | [#0] ai-astar Cycles:10 Average:114.70 Median:114.00 stddev:4.32 (3.8%) stddev-sans-first:4.58 16:21:14 INFO - PROCESS | 12672 | Values: 115.0 109.0 115.0 114.0 113.0 126.0 114.0 114.0 114.0 113.0 16:21:14 INFO - PROCESS | 12672 | 16:21:14 INFO - PROCESS | 12672 | [#1] audio-beat-detection Cycles:10 Average:152.50 Median:156.00 stddev:17.61 (11.3%) stddev-sans-first:18.66 16:21:14 INFO - PROCESS | 12672 | Values: 155.0 135.0 157.0 171.0 134.0 150.0 162.0 135.0 187.0 139.0 16:21:14 INFO - PROCESS | 12672 | 16:21:14 INFO - PROCESS | 12672 | [#2] audio-dft Cycles:10 Average:164.60 Median:164.50 stddev:2.76 (1.7%) stddev-sans-first:2.86 16:21:14 INFO - PROCESS | 12672 | Values: 163.0 161.0 164.0 165.0 163.0 164.0 170.0 166.0 168.0 162.0 16:21:14 INFO - PROCESS | 12672 | 16:21:14 INFO - PROCESS | 12672 | [#3] audio-fft Cycles:10 Average:80.50 Median:73.00 stddev:18.39 (25.2%) stddev-sans-first:19.40 16:21:14 INFO - PROCESS | 12672 | Values: 75.0 71.0 76.0 72.0 131.0 73.0 73.0 73.0 73.0 88.0 16:21:14 INFO - PROCESS | 12672 | 16:21:14 INFO - PROCESS | 12672 | [#4] audio-oscillator Cycles:10 Average:109.60 Median:97.00 stddev:19.87 (20.5%) stddev-sans-first:20.62 16:21:14 INFO - PROCESS | 12672 | Values: 98.0 97.0 138.0 97.0 98.0 97.0 141.0 97.0 97.0 136.0 16:21:14 INFO - PROCESS | 12672 | 16:21:14 INFO - PROCESS | 12672 | [#5] imaging-gaussian-blur Cycles:10 Average:110.40 Median:110.50 stddev:1.07 (1.0%) stddev-sans-first:0.97 16:21:14 INFO - PROCESS | 12672 | Values: 112.0 111.0 110.0 111.0 109.0 110.0 110.0 110.0 109.0 112.0 16:21:14 INFO - PROCESS | 12672 | 16:21:14 INFO - PROCESS | 12672 | [#6] imaging-darkroom Cycles:10 Average:148.20 Median:148.00 stddev:0.92 (0.6%) stddev-sans-first:0.97 16:21:14 INFO - PROCESS | 12672 | Values: 148.0 148.0 147.0 147.0 148.0 149.0 148.0 150.0 149.0 148.0 16:21:14 INFO - PROCESS | 12672 | 16:21:14 INFO - PROCESS | 12672 | [#7] imaging-desaturate Cycles:10 Average:96.30 Median:96.00 stddev:0.48 (0.5%) stddev-sans-first:0.50 16:21:14 INFO - PROCESS | 12672 | Values: 96.0 96.0 97.0 96.0 96.0 96.0 96.0 97.0 97.0 96.0 16:21:14 INFO - PROCESS | 12672 | 16:21:14 INFO - PROCESS | 12672 | [#8] json-parse-financial Cycles:10 Average:69.60 Median:70.00 stddev:0.84 (1.2%) stddev-sans-first:0.88 16:21:14 INFO - PROCESS | 12672 | Values: 70.0 70.0 69.0 69.0 70.0 68.0 71.0 69.0 70.0 70.0 16:21:14 INFO - PROCESS | 12672 | 16:21:14 INFO - PROCESS | 12672 | [#9] json-stringify-tinderbox Cycles:10 Average:69.20 Median:69.00 stddev:1.32 (1.9%) stddev-sans-first:1.32 16:21:14 INFO - PROCESS | 12672 | Values: 68.0 68.0 72.0 69.0 71.0 69.0 69.0 69.0 69.0 68.0 16:21:14 INFO - PROCESS | 12672 | 16:21:14 INFO - PROCESS | 12672 | [#10] stanford-crypto-aes Cycles:10 Average:84.40 Median:85.00 stddev:1.26 (1.5%) stddev-sans-first:1.00 16:21:14 INFO - PROCESS | 12672 | Values: 82.0 85.0 83.0 85.0 86.0 84.0 85.0 84.0 86.0 84.0 16:21:14 INFO - PROCESS | 12672 | 16:21:14 INFO - PROCESS | 12672 | [#11] stanford-crypto-ccm Cycles:10 Average:124.90 Median:124.00 stddev:4.33 (3.5%) stddev-sans-first:4.54 16:21:14 INFO - PROCESS | 12672 | Values: 123.0 120.0 124.0 131.0 123.0 130.0 124.0 131.0 124.0 119.0 16:21:14 INFO - PROCESS | 12672 | 16:21:14 INFO - PROCESS | 12672 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:151.20 Median:152.50 stddev:8.97 (5.9%) stddev-sans-first:9.23 16:21:14 INFO - PROCESS | 12672 | Values: 145.0 157.0 164.0 148.0 151.0 137.0 154.0 164.0 151.0 141.0 16:21:14 INFO - PROCESS | 12672 | 16:21:14 INFO - PROCESS | 12672 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:72.70 Median:72.50 stddev:2.41 (3.3%) stddev-sans-first:2.54 16:21:14 INFO - PROCESS | 12672 | Values: 72.0 72.0 72.0 71.0 76.0 69.0 77.0 73.0 71.0 74.0 16:21:14 INFO - PROCESS | 12672 | -------- Summary: end -------- 16:21:14 INFO - PROCESS | 12672 | 16:21:15 INFO - TEST-INFO | 12672: exit 0 16:21:15 INFO - TEST-OK | kraken | took 62013ms 16:21:15 INFO - TEST-START | v8_7 16:21:15 INFO - operating with platform_type : linux_ 16:21:15 INFO - Initialising browser for v8_7 test... 16:21:15 INFO - TEST-INFO | started process 12956 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpjFMTvt/profile http://localhost:32962/getInfo.html) 16:21:19 INFO - PROCESS | 12956 | 16:21:19 INFO - PROCESS | 12956 | (process:13028): GLib-CRITICAL **: g_path_get_basename: assertion `file_name != NULL' failed 16:21:20 INFO - PROCESS | 12956 | __metrics Screen width/height:1600/1200 16:21:20 INFO - PROCESS | 12956 | colorDepth:24 16:21:20 INFO - PROCESS | 12956 | Browser inner width/height: 1024/697 16:21:20 INFO - PROCESS | 12956 | __metrics 16:21:20 INFO - PROCESS | 12956 | JavaScript error: resource://gre/modules/PerformanceStats.jsm, line 211: NS_ERROR_NOT_AVAILABLE: Component returned failure code: 0x80040111 (NS_ERROR_NOT_AVAILABLE) [nsIPerformanceStatsService.isMonitoringJank] 16:21:21 INFO - TEST-INFO | 12956: exit 0 16:21:21 INFO - Browser initialized. 16:21:21 INFO - Running cycle 1/1 for v8_7 test... 16:21:21 INFO - TEST-INFO | started process 13077 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpjFMTvt/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/v8_7/v8.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 16:21:23 INFO - PROCESS | 13077 | 16:21:23 INFO - PROCESS | 13077 | (process:13133): GLib-CRITICAL **: g_path_get_basename: assertion `file_name != NULL' failed 16:21:33 INFO - PROCESS | 13077 | RSS: Main: 151150592 16:21:33 INFO - PROCESS | 13077 | 16:21:56 INFO - PROCESS | 13077 | Cycle 1(1): loaded http://localhost:32962/tests/v8_7/run.html (next: http://localhost:32962/tests/v8_7/run.html) 16:21:56 INFO - PROCESS | 13077 | RSS: Main: 146640896 16:21:56 INFO - PROCESS | 13077 | 16:21:56 INFO - PROCESS | 13077 | __start_tp_report 16:21:56 INFO - PROCESS | 13077 | _x_x_mozilla_page_load 16:21:56 INFO - PROCESS | 13077 | _x_x_mozilla_page_load_details 16:21:56 INFO - PROCESS | 13077 | |i|pagename|runs| 16:21:56 INFO - PROCESS | 13077 | |0;Richards;167.39203213927016 16:21:56 INFO - PROCESS | 13077 | |1;DeltaBlue;189.07165815844206 16:21:56 INFO - PROCESS | 13077 | |2;Encrypt;277.85495971103086 16:21:56 INFO - PROCESS | 13077 | |3;Decrypt;5256.544502617801 16:21:56 INFO - PROCESS | 13077 | |4;RayTrace;1077.5862068965516 16:21:56 INFO - PROCESS | 13077 | |5;Earley;703.4434293745608 16:21:56 INFO - PROCESS | 13077 | |6;Boyer;12378.048780487805 16:21:56 INFO - PROCESS | 13077 | |7;RegExp;43042.55319148936 16:21:56 INFO - PROCESS | 13077 | |8;Splay;587.0327102803739 16:21:56 INFO - PROCESS | 13077 | |9;NavierStokes;4840.579710144928 16:21:56 INFO - PROCESS | 13077 | __end_tp_report 16:21:56 INFO - PROCESS | 13077 | __startTimestamp1452903716638__endTimestamp 16:21:56 INFO - PROCESS | 13077 | 16:21:56 INFO - PROCESS | 13077 | ------- Summary: start ------- 16:21:56 INFO - PROCESS | 13077 | Number of tests: 10 16:21:56 INFO - PROCESS | 13077 | 16:21:56 INFO - PROCESS | 13077 | [#0] Richards Cycles:1 Average:167.39 Median:167.39 stddev:0.00 (0.0%) 16:21:56 INFO - PROCESS | 13077 | Values: 167.4 16:21:56 INFO - PROCESS | 13077 | 16:21:56 INFO - PROCESS | 13077 | [#1] DeltaBlue Cycles:1 Average:189.07 Median:189.07 stddev:0.00 (0.0%) 16:21:56 INFO - PROCESS | 13077 | Values: 189.1 16:21:56 INFO - PROCESS | 13077 | 16:21:56 INFO - PROCESS | 13077 | [#2] Encrypt Cycles:1 Average:277.85 Median:277.85 stddev:0.00 (0.0%) 16:21:56 INFO - PROCESS | 13077 | Values: 277.9 16:21:56 INFO - PROCESS | 13077 | 16:21:56 INFO - PROCESS | 13077 | [#3] Decrypt Cycles:1 Average:5256.54 Median:5256.54 stddev:0.00 (0.0%) 16:21:56 INFO - PROCESS | 13077 | Values: 5256.5 16:21:56 INFO - PROCESS | 13077 | 16:21:56 INFO - PROCESS | 13077 | [#4] RayTrace Cycles:1 Average:1077.59 Median:1077.59 stddev:0.00 (0.0%) 16:21:56 INFO - PROCESS | 13077 | Values: 1077.6 16:21:56 INFO - PROCESS | 13077 | 16:21:56 INFO - PROCESS | 13077 | [#5] Earley Cycles:1 Average:703.44 Median:703.44 stddev:0.00 (0.0%) 16:21:56 INFO - PROCESS | 13077 | Values: 703.4 16:21:56 INFO - PROCESS | 13077 | 16:21:56 INFO - PROCESS | 13077 | [#6] Boyer Cycles:1 Average:12378.05 Median:12378.05 stddev:0.00 (0.0%) 16:21:56 INFO - PROCESS | 13077 | Values: 12378.0 16:21:56 INFO - PROCESS | 13077 | 16:21:56 INFO - PROCESS | 13077 | [#7] RegExp Cycles:1 Average:43042.55 Median:43042.55 stddev:0.00 (0.0%) 16:21:56 INFO - PROCESS | 13077 | Values: 43042.6 16:21:56 INFO - PROCESS | 13077 | 16:21:56 INFO - PROCESS | 13077 | [#8] Splay Cycles:1 Average:587.03 Median:587.03 stddev:0.00 (0.0%) 16:21:56 INFO - PROCESS | 13077 | Values: 587.0 16:21:56 INFO - PROCESS | 13077 | 16:21:56 INFO - PROCESS | 13077 | [#9] NavierStokes Cycles:1 Average:4840.58 Median:4840.58 stddev:0.00 (0.0%) 16:21:56 INFO - PROCESS | 13077 | Values: 4840.6 16:21:56 INFO - PROCESS | 13077 | -------- Summary: end -------- 16:21:56 INFO - PROCESS | 13077 | 16:21:57 INFO - TEST-INFO | 13077: exit 0 16:21:57 INFO - TEST-OK | v8_7 | took 42371ms 16:21:57 INFO - SUITE-END | took 1219s 16:21:58 INFO - Completed test suite (00:20:19) 16:21:58 INFO - Working with test: dromaeo_css 16:21:58 INFO - Generating results file: dromaeo_css 16:21:58 INFO - Working with test: kraken 16:21:58 INFO - Generating results file: kraken 16:21:58 INFO - javascript benchmark 16:21:58 INFO - Working with test: v8_7 16:21:58 INFO - Generating results file: v8_7 16:21:58 INFO - Posting result 0 of 3 to http://graphs.mozilla.org/server/collect.cgi, attempt 0 16:21:58 INFO - process_Request line: dromaeo_css graph.html#tests=[[72,132,43]] 16:21:58 INFO - process_Request line: dromaeo_css 5961.71 graph.html#tests=[[72,132,43]] 16:21:58 INFO - Posting result 1 of 3 to http://graphs.mozilla.org/server/collect.cgi, attempt 0 16:21:58 INFO - process_Request line: kraken 1548.80 graph.html#tests=[[232,132,43]] 16:21:58 INFO - Posting result 2 of 3 to http://graphs.mozilla.org/server/collect.cgi, attempt 0 16:21:58 INFO - process_Request line: v8_7 20310.51 graph.html#tests=[[230,132,43]] 16:21:58 INFO - RETURN: dromaeo_css: 5961.71 16:21:58 INFO - RETURN: kraken: 1548.80 16:21:58 INFO - RETURN: v8_7: 20310.51 16:21:58 INFO - javascript benchmark 16:21:58 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"lowerIsBetter": false, "subtests": [{"lowerIsBetter": false, "replicates": [2616.9738302616975, 2617.358747106959, 2647.48374067057, 2664.4671065786847, 2673.144593730006, 4473.575010374017, 4506.391637128991, 4572.977135114324, 4573.794179261933, 4587.266037434007, 4468.910621787562, 4530.229860923642, 4573.748443835588, 4613.74624395659, 4637.188492013901, 4095.508538975327, 4187.1416359646355, 4234.06850492891, 4239.851605193811, 4327.7186982846015, 4300.118475712487, 4313.525512193672, 4333.566643335673, 4337.240982828008, 4357.38996540483, 4076.1236334188143, 4145.606167414091, 4179.373094035888, 4208.810603522818, 4243.3634954757035, 4225.218334608107, 4228.112096459748, 4234.788260586989, 4242.193983143224, 4270.252705776476, 4102.425660407545, 4198.706090573661, 4205.411242426063, 4216.051388437608, 4222.556631553704, 4354.716943398669, 4428.31361139024, 4533.410656614652, 4535.047639995605, 4577.8397756078375, 4861.51384861511, 4871.56155945963, 4871.610271178297, 4877.804887804484, 4886.413630364344, 4722.811087556528, 4823.807047718087, 4885.218365061609, 4898.926516102226, 4924.581410580069, 4474.194644963938, 4527.683062185648, 4544.613707834871, 4571.748553829571, 4603.447586289667, 4972.602191824718, 4987.600991920638, 4988.950110498921, 4989.476105008995, 5029.0, 4677.6257899367965, 4744.739039352799, 4773.498782627844, 4784.68899521537, 4839.1531481991215, 4889.462159162489, 4891.461939186686, 4928.654994150375, 4932.728699921467, 4980.904201075758, 4800.5199480051715, 4819.349387832668, 4841.612670986313, 4842.927356089662, 4850.708957462563, 4578.793954272066, 4677.789499472532, 4753.714777113384, 4826.420829500412, 4827.806887724522, 4023.054582173187, 4025.4163146343617, 4050.41269015991, 4057.89855253621, 4100.979495102565, 3587.8385472653795, 3588.085038315265, 3589.4077477215965, 3610.8555657773395, 3632.182758879231, 4134.875953721393, 4227.091175397304, 4243.8090285937205, 4285.721428107226, 4291.806868690916, 4835.975820120947, 4837.9032419351415, 4838.709677419366, 4838.95161048392, 4907.944791869765, 4212.91574168521, 4217.641500472494, 4224.070704445017, 4233.5131459881895, 4258.936115958263, 4215.662746980234, 4279.743215407086, 4330.242207613655, 4358.019445624709, 4400.779961002001, 4489.842855500042, 4522.796474158671, 4557.863264102082, 4565.817367305403, 4603.562661547147, 4728.40894888139, 4797.784099715452, 4814.181589129927, 4820.084184005028, 4856.368672072608, 4576.26779715244, 4593.058423023205, 4639.0, 4665.0, 4690.108879313056, 4742.099001189763, 4789.95210047895, 4792.08950299456, 4793.520647935178, 4821.325014497903, 4725.0, 4806.543378379049, 4851.539103785135, 4855.465898751205, 4905.2151655734915, 4667.953320466752, 4671.43942726875, 4684.859454216379, 4701.529847015271, 4749.525047495223, 4724.551167639069, 4743.739094349844, 4744.976275118603, 4767.261074533453, 4811.49479304668, 4489.910201796011, 4559.452865656142, 4580.67935244543, 4643.976780116078, 4676.181668208118, 4770.546798054179, 4811.230203167476, 4815.277708343777, 4833.468318484894, 4854.101991131652, 4652.209124448919, 4660.836870709509, 4703.20045592257, 4704.741239231875, 4741.217699079613], "unit": "score", "name": "dojo.html", "value": 4467.9957992673135}, {"lowerIsBetter": false, "replicates": [479.0562591694363, 500.09982032341776, 502.8214983680796, 505.12108930461, 526.2816255810818, 23511.412214694643, 31877.840610796942, 32403.837980810124, 32451.188720282003, 32498.350032999326, 35658.465123023176, 35787.4631880522, 35957.46063809045, 36021.81989090057, 36335.4549681755, 7508.737194198217, 7692.3076923076915, 7694.5383277003275, 7694.961525192366, 7701.884471732928, 7535.434842386816, 7586.58273794941, 7607.581583012932, 7616.543007419545, 7662.348700360476, 7638.312551870331, 7654.693812247503, 7717.151113377552, 7731.845363092735, 7737.187595302496, 7581.962090189541, 7643.961780191119, 7660.348870346055, 7841.372690184829, 7852.018497687789, 7641.617919104078, 7775.494592851446, 7783.066032076131, 7791.4935529190425, 7796.844063118706, 35793.82103089468, 36057.0, 36179.81910090433, 36315.455268171, 36331.818340908125, 2733.6992930777596, 2810.5924640927155, 2924.5320748680324, 3036.893708720206, 3215.437298472758, 24143.15498957528, 24334.0, 24554.631680524806, 24764.133255336157, 25164.748352516424, 3242.6108866935883, 3463.757536972413, 3497.8251087445524, 3506.66686664769, 3537.00963730156, 217485.0, 217910.0, 217915.0, 218099.0, 218107.0, 42076.0, 42176.36735448971, 43124.0, 47831.282530762066, 48916.287929922284, 46733.0, 46742.0, 46798.0, 46883.29675054877, 47039.76480117578, 13796.517121900686, 14079.366428510742, 14119.152850828777, 14171.574852754227, 14218.217998010003, 10581.735456613646, 10588.735281618021, 10599.205059620559, 10663.733406664895, 10711.625093121704, 17250.827491725173, 17497.387591434494, 17533.82466175322, 17619.735703964194, 17627.82372176262, 6615.503837212132, 6791.660416979132, 6828.351306625863, 6851.0, 6860.794176174722, 668.7993601919502, 770.7918861907253, 830.4979510741339, 833.0, 841.3899922556097, 24776.628350574756, 25445.87277063603, 25553.872230638728, 25633.359166021, 25646.615300770503, 890.7149712092198, 950.5294879034784, 959.0361686505157, 961.8797650293714, 1047.6223765748168, 13285.73428531424, 13484.325783710776, 14099.295035248197, 14223.928880355532, 14359.569212923629, 208110.0, 208253.0, 210599.0, 210638.0, 211437.0, 41230.0, 41485.79257103695, 41553.79223103865, 41567.58432415637, 41647.58352416498, 1070.577122036791, 1235.9567415140427, 1236.4744983382027, 1243.7450322683828, 1245.4084309952882, 23803.761962380155, 24783.50432991294, 25664.743352566235, 25703.357416064748, 25798.484030319665, 38398.61601384062, 38667.2266554673, 38870.41694374643, 39128.2174356517, 39137.0, 200588.9587728845, 201007.0, 202759.0, 202924.0, 203269.0, 27419.588706169823, 27737.583936240568, 28124.29689257703, 28193.43613127685, 28243.71756282493, 32060.0, 32206.0, 32329.0, 32883.67116328806, 33008.1747956303, 27801.860990695724, 28352.85823570869, 30590.84704576463, 30605.693943060283, 31015.534766978966, 30040.84979575088, 30101.548476773303, 30130.84934575313, 30137.09588712342, 30572.694273057874, 30379.544306835858, 30838.69161308358, 30893.38213235678, 31000.22499437532, 31011.379772404878, 26621.600675990263, 27422.314442139104, 27897.721022789512, 27983.720162798112, 28026.719732802412, 22308.330750077523, 22355.44111397228, 22453.21413750576, 22503.549929001656, 22672.65991010169], "unit": "score", "name": "ext.html", "value": 15622.19212922919}, {"lowerIsBetter": false, "replicates": [344.12592016278654, 345.31799695601177, 348.75412833952066, 348.76109864742654, 352.0529774905504, 13950.302484875767, 14169.362378692958, 15119.319630616621, 15293.84706152938, 15750.448734294274, 9757.658481953133, 9985.650502232424, 12169.634910952664, 14872.256387180652, 14964.401423943056, 4430.734155950645, 4578.885527861814, 4587.495375508692, 4798.0, 4967.031428871372, 4849.296851956464, 4882.584980276681, 4925.655204135712, 4937.77779999899, 4947.381577302837, 4795.616350691954, 4972.0801651694555, 4972.726500042496, 5136.614753893455, 5139.820106296281, 4883.218685010399, 4898.167311557044, 4931.309616653672, 4947.134251505972, 5726.713664316768, 5134.486551344873, 5136.845894623168, 5143.3570803649545, 5149.639525233235, 5154.433012368637, 10856.294340867818, 16588.75116873248, 17657.558561036076, 18255.178516966636, 18402.171902264432, 1761.8150094240177, 1857.990710046441, 1876.587150826816, 1912.741779859715, 1937.060525645061, 8192.467489613156, 8297.709580164727, 8301.211384918422, 8740.431871928367, 9929.156021738161, 1693.09419460588, 1708.6241026974046, 1717.2186655072037, 1738.5219064757166, 1761.6476704658992, 46645.76677116593, 47586.28620570694, 48049.75975120137, 49754.0, 51097.744511277575, 8655.52394618302, 9081.68214112503, 9304.627814887464, 9373.39072960269, 9497.192738617296, 11433.028192603555, 11500.48247828833, 11531.365774882463, 11535.250208736405, 11542.07663386927, 6555.246146693096, 6816.113905192294, 6897.827554311182, 6919.861602767916, 6956.65216739161, 6214.4407003369915, 6222.719977600928, 6360.236771587439, 6423.4861211103, 6470.4823614110755, 4033.0, 4105.8973525662095, 4115.938260926088, 4135.8966025849595, 4148.211839750437, 1593.306911493504, 1776.7157254839165, 1781.2162648434648, 1812.6555954368628, 1825.4797382745853, 336.9655158662881, 341.2833050593783, 344.9862005519751, 346.73821264944803, 768.5849641193693, 14207.857921420653, 14983.925080374747, 15027.248637568078, 15549.455769048256, 16065.518034458984, 822.3585603229491, 842.9662813487391, 867.4318321499428, 872.097379212512, 874.3617159473492, 8570.785730356667, 8576.957115214509, 8647.351448641251, 8694.478331300143, 8770.736877893672, 423558.0, 424638.0, 428359.0, 445167.0, 458575.0, 60174.0, 61477.38522614806, 62368.37631623716, 64116.679416602616, 65646.67176664087, 1001.6794625719846, 1030.9123724483502, 1035.6219979707353, 1037.159900480613, 1046.0533217438078, 13493.730125397633, 13636.181829090287, 13685.75448259358, 13804.861951380759, 13971.860281397463, 29549.0, 29653.0, 29787.55318670265, 30100.54849177308, 30159.944401945828, 37188.44217336796, 38004.239915202095, 38056.0, 38146.237075257784, 39057.6094239054, 5918.437748413894, 6064.878702426015, 6117.877642447215, 6121.081837724377, 6165.32181460048, 6694.564853284521, 8793.648254070022, 9136.223421009023, 9316.44101353921, 9385.0, 7527.661255243636, 7876.921230787619, 7881.487703299267, 7946.443748937751, 8160.26557609818, 3878.7478813877005, 7645.5794931279315, 8205.425620206528, 8378.204070613281, 8503.362247831561, 8273.875891861748, 8413.537255451009, 8434.746957591282, 8565.914340856762, 8711.041785403473, 6021.54838387114, 6167.784127555514, 6182.28903676083, 6241.719122639583, 6253.0, 7517.774466766005, 8105.918940810752, 8146.906870471909, 8191.098979112412, 8209.343252539902], "unit": "score", "name": "jquery.html", "value": 7071.600241615163}, {"lowerIsBetter": false, "replicates": [1381.509564104743, 1403.8806701430378, 1497.7378958682234, 1663.7005339038967, 1676.8993860368387, 5767.913481297774, 5884.323302820167, 6501.4473769729575, 6645.700943457544, 6649.035889795977, 6473.514486413526, 6670.266270710218, 6712.261651218374, 6713.832154196148, 6736.932630673692, 2010.3968809357207, 2028.1177687705822, 2037.684158955357, 2038.1949130093603, 2039.255671679841, 1978.1889425335614, 1992.5915187386624, 1996.131682718015, 2027.0, 2030.5735795482892, 2009.2063634864219, 2016.5563576013253, 2019.121682068305, 2027.6654352031971, 2030.0560239488634, 2061.1858315965183, 2067.7415323084615, 2070.0581235537793, 2070.6479898417306, 2070.8446866485074, 2014.74815648044, 2029.6042271757012, 2034.104993802722, 2035.3486884197064, 2037.0425899827057, 6953.130858642669, 6959.6868140933775, 6975.930240697629, 6985.755498557577, 6988.860222795566, 3905.0627849316243, 3929.6659783918403, 3973.6225058619384, 3980.960190398088, 3985.8405663773415, 2569.473257982128, 2583.8760139339447, 2618.1883616078885, 2663.840169589831, 2664.0542607374296, 829.713748756678, 843.0978852627691, 857.5455008845322, 858.9312854971587, 1703.7529558214114, 8786.956065219632, 8851.513166775825, 8857.468551886843, 8887.60005799734, 8889.333300002461, 3380.509826075205, 3434.9313013739584, 3468.514407982884, 3482.094655389617, 3517.683408493248, 7286.854262914712, 7288.052553168161, 7292.270772922665, 7295.0, 7295.52579082358, 3891.6886649068006, 3912.8043597820565, 3917.9608203918165, 3973.662238709684, 3983.083890705096, 3513.209527856212, 3611.422172452395, 3618.4029635109914, 3649.616790236987, 3674.8346324415465, 2927.2535503446484, 2993.027266138514, 2998.835064071497, 3003.414334204809, 3007.8195308281574, 891.3225948279354, 894.0478390514081, 902.1474706402387, 904.9638014479347, 919.5540163020929, 834.0, 839.341117222977, 843.9156084391634, 846.2341580869323, 1023.2172388123092, 6393.456556192683, 6420.839479013062, 6422.8715425691225, 6423.935760642427, 6425.807225783234, 387.18111194822745, 387.67822707152993, 387.7285899870102, 390.09303369665076, 394.5482422626077, 5016.54851063406, 5119.897602047939, 5123.923141152885, 5146.279520867081, 5152.92270615941, 7474.177840437547, 7641.579713115832, 8168.714095006765, 8305.916940830515, 8311.625976831057, 7830.92169078302, 8001.199880011952, 8007.279344858991, 8009.719659811879, 8060.15368386311, 6428.19647544057, 6460.676966151674, 6508.674566271668, 6536.542442029107, 6560.475161987029, 6498.220213574401, 6572.145621069421, 6577.80266592003, 6587.242467116152, 6607.768728094494, 7359.632018399166, 7390.482666213314, 7469.402447804054, 7523.0972283326355, 7599.126100498514, 7479.588622625808, 7678.846423071395, 7688.884666730115, 7720.729774457867, 7732.536047837148, 5356.732163391893, 5490.862728431821, 6124.8775024500155, 6197.597156184834, 6221.377862213742, 6411.230652321751, 6520.771772987922, 6547.672616369067, 6557.180352455943, 6561.278259391368, 6003.234800900933, 6255.280642726145, 6267.1539342188225, 6311.936880631135, 6394.712237949397, 5970.9701451492465, 5983.611065280743, 6053.878922421615, 6054.6064505808745, 6174.753009879554, 6043.305019922589, 6086.817395478142, 6099.390060994043, 6123.418275263843, 6150.415710507495, 5718.771249149988, 5720.656760594377, 5749.942500574941, 5759.366469688247, 5769.278840144982, 5580.051391263414, 5640.407757185437, 5647.745851436777, 5761.308642962871, 5763.106718458645], "unit": "score", "name": "mootools.html", "value": 3793.5024835300783}, {"lowerIsBetter": false, "replicates": [272.6727926488214, 276.0999142794489, 278.5139930820716, 279.9230211691785, 280.6379770096577, 5374.113271310239, 5488.670679759217, 5590.4130066343005, 5640.661560306379, 5662.094064949614, 5540.252065971093, 5644.350899646542, 5650.29371328584, 5651.8304450866535, 5667.801626943058, 4267.445232119836, 4272.295071313238, 4281.229378711831, 4281.8287268509375, 4286.03564198056, 4279.144171165779, 4286.164197981395, 4293.22721910056, 4307.095509942916, 4313.805878735465, 4227.112306415641, 4244.363345498169, 4249.128928569636, 4254.978725106385, 4258.488981322245, 4005.158916627497, 4144.233316836395, 4145.17096580682, 4191.098913733562, 4200.579942005806, 3579.7494175407733, 3581.6955558777536, 3581.7850928944345, 3582.42681171014, 3587.336342776595, 5373.596980226499, 5382.946170538284, 5393.056215162331, 5395.649282796606, 5397.190421436777, 4739.834105806281, 4781.976090119562, 4783.115123702126, 4797.784099715521, 4798.592119669832, 5594.580406469531, 5638.069718496443, 5807.216025836543, 5824.0, 5864.354920958691, 3835.7314987950854, 3840.539135303781, 3841.615838416164, 3848.942265866014, 3849.9230015399535, 6081.391860813883, 6149.815505534841, 6161.907571386388, 6171.25944886612, 6178.5366097542865, 3915.099527108781, 3949.407588861636, 3953.2291203215095, 3955.7428767130045, 3969.8884312392574, 3864.632859878307, 4022.1754540319166, 4028.576999415078, 4028.818703158306, 4048.27131116396, 4728.290756386569, 4737.123632128068, 4738.620910327166, 4742.810287588458, 4750.14497390473, 5909.29088509373, 5920.259967504062, 5932.970335148297, 5935.73289201987, 5939.613925094855, 1404.206623257856, 1427.4789701758991, 1429.106808244847, 1433.4982756035304, 1433.8781203597812, 914.2594498456272, 925.4632313258294, 926.1895841139003, 946.4888959961544, 950.5579905344048, 5140.254663073833, 5148.9485105149215, 5157.742112894341, 5160.329157209614, 5173.379194496684, 6106.755729770848, 6118.326984031842, 6121.816345509642, 6124.969375153096, 6125.0, 5121.948780512222, 5136.5890728741615, 5137.640365174477, 5144.408393034774, 5168.069747445421, 3230.095573239497, 3290.177455636091, 3318.900432987014, 3319.7012268895915, 3324.517944897976, 5784.305883294031, 5792.0732682771395, 5811.941880581225, 5813.593048486566, 5813.651180929158, 6356.459700925473, 6375.139356186948, 6375.840603984938, 6396.232452105777, 6402.135711678957, 5618.185363122406, 5782.826515204551, 5785.681787501728, 5813.6221145625395, 5828.154917536934, 5878.676672782867, 6026.337102918763, 6069.362716914837, 6179.16581261524, 6201.937980620136, 6043.54673399488, 6048.90926636092, 6054.66699331541, 6062.908676438284, 6065.939340606537, 5768.423157684198, 5778.757567123089, 5784.537237021113, 5787.189793429007, 5787.508061814793, 3855.383138697795, 3943.309920763912, 3970.4639873616693, 3991.5409727881665, 3997.440358349775, 6083.513318934386, 6084.787032453843, 6114.144019837316, 6123.479504242189, 6127.662978536223, 5877.23595932526, 5882.352941176381, 5888.381719919346, 5888.941110588839, 5900.262467191601, 5717.828465146053, 5883.235179426647, 5885.440883116097, 5900.11498275245, 5908.291005079418, 5768.394318596487, 5772.393898640582, 5782.595218334676, 5809.535237180931, 5825.621334613236, 5953.404659534185, 5969.611975221596, 5975.073863551156, 5979.611325263844, 5981.0, 5741.368449470639, 5787.913181302368, 5875.118732190205, 5880.647161170344, 5882.441168089024], "unit": "score", "name": "prototype.html", "value": 4333.936168431064}, {"lowerIsBetter": false, "replicates": [682.1916029505034, 706.3819158236543, 758.6434375843352, 782.2881178127903, 812.874004529298, 11207.775844483105, 11304.095672346213, 11340.206185567014, 11371.147163962705, 11414.143939204552, 12624.305663188521, 12644.178128421669, 12692.682682932931, 12776.0, 12843.35783210838, 745.955242685438, 751.7030772844723, 769.1692971590696, 774.2335088262607, 774.5391492062242, 761.8819083042109, 762.1235579084042, 766.643510767493, 766.8274638206386, 769.2499812682618, 794.9920500794976, 795.8448102619991, 797.7766225456852, 798.6925033861976, 801.6312496251702, 772.6986475274647, 780.5706861226303, 782.5226611766818, 784.2040329066002, 784.7802615267734, 584.4214227914376, 585.4058130996999, 585.7598384662268, 586.5864565481326, 587.6151121015741, 11972.461239244254, 12030.759384812342, 12041.518339266418, 12043.578474753429, 12081.27512349253, 10963.342199467977, 11312.377819219939, 11401.201915865893, 11411.0, 11730.061595072373, 9431.386959847589, 9500.477473738942, 9523.571439285179, 9532.52337383128, 9554.48041021953, 3277.3936821687826, 3287.4411350070545, 3310.3710295043866, 3334.4664853623544, 3348.41402754517, 35110.0, 35318.47022294668, 35403.82298088519, 35418.46872296918, 35507.822460887786, 9066.184043436122, 9126.13301736334, 9170.49562274068, 9214.433546297145, 9350.95324523373, 15364.0, 15408.691826163415, 15503.224838758017, 15541.0, 15541.222938853012, 6536.640484773288, 6596.835079122964, 6606.900896486556, 6648.800535983928, 6771.864562708718, 3476.704480119168, 3483.8155027290336, 3497.982510087433, 3526.3123690880034, 3541.7520773545602, 2496.6379874918034, 2549.107812265729, 2552.3874270175024, 2552.7447255274697, 2558.8976440942156, 452.5949275398566, 456.6095987930272, 457.77340216593, 458.6055991847009, 460.69363873024065, 402.89204687110447, 432.4464685202945, 537.4437457231746, 569.3822202909806, 587.1896782440206, 7260.92739072613, 7434.368078713262, 7439.925600744032, 7585.0, 7764.8058798529355, 441.17720451357985, 517.9559737422361, 581.7149596697587, 582.6387639663351, 612.4579746923915, 3437.9312413751586, 3453.620101788801, 3526.4710293456187, 3718.5909549949483, 3752.512173417438, 46861.53138468572, 47333.76333118312, 47592.7620361896, 51760.74119629378, 51895.962080758174, 40913.0, 42207.788961055, 42247.366289505684, 42565.574344256784, 43301.566984330384, 36116.0, 36270.4559431614, 36958.445623315674, 39100.0, 39592.60407395889, 7417.740379086706, 7893.289603935674, 7961.8407631848195, 8167.264946154874, 8340.249377556049, 28634.284142896595, 28676.713232867405, 29234.41531169322, 29319.120426387242, 29443.411131777673, 34797.0, 35154.64845351616, 35540.822295888356, 36236.63763362333, 38530.80734596309, 9832.655857044969, 9835.0, 9937.950310248403, 10179.083882450319, 10187.134093602126, 10986.780264394827, 11035.062019728091, 11133.665990020312, 11134.721631959266, 11780.293182409083, 10427.791444171226, 10727.302725322828, 10733.141348692243, 10924.726881828017, 11129.276597021168, 8973.192412682889, 9075.410098343587, 9300.906990930003, 9465.432074075577, 9534.761630959281, 9957.352772069793, 10336.896631033593, 10661.733456663645, 10710.196735245043, 10743.409112498888, 8059.3552515799765, 8127.75902363015, 8203.548804815793, 8363.874541881754, 8477.38221300827, 8437.114103019094, 8575.356848236532, 8625.741227763177, 8981.865272020794, 9019.188273055457], "unit": "score", "name": "yui.html", "value": 5532.048798704529}], "name": "dromaeo_css", "value": 5961.707149459512}, {"lowerIsBetter": true, "subtests": [{"lowerIsBetter": true, "replicates": [115.0, 109.0, 115.0, 114.0, 113.0, 126.0, 114.0, 114.0, 114.0, 113.0], "unit": "score", "name": "ai-astar", "value": 114.7}, {"lowerIsBetter": true, "replicates": [155.0, 135.0, 157.0, 171.0, 134.0, 150.0, 162.0, 135.0, 187.0, 139.0], "unit": "score", "name": "audio-beat-detection", "value": 152.5}, {"lowerIsBetter": true, "replicates": [163.0, 161.0, 164.0, 165.0, 163.0, 164.0, 170.0, 166.0, 168.0, 162.0], "unit": "score", "name": "audio-dft", "value": 164.6}, {"lowerIsBetter": true, "replicates": [75.0, 71.0, 76.0, 72.0, 131.0, 73.0, 73.0, 73.0, 73.0, 88.0], "unit": "score", "name": "audio-fft", "value": 80.5}, {"lowerIsBetter": true, "replicates": [98.0, 97.0, 138.0, 97.0, 98.0, 97.0, 141.0, 97.0, 97.0, 136.0], "unit": "score", "name": "audio-oscillator", "value": 109.6}, {"lowerIsBetter": true, "replicates": [112.0, 111.0, 110.0, 111.0, 109.0, 110.0, 110.0, 110.0, 109.0, 112.0], "unit": "score", "name": "imaging-gaussian-blur", "value": 110.4}, {"lowerIsBetter": true, "replicates": [148.0, 148.0, 147.0, 147.0, 148.0, 149.0, 148.0, 150.0, 149.0, 148.0], "unit": "score", "name": "imaging-darkroom", "value": 148.2}, {"lowerIsBetter": true, "replicates": [96.0, 96.0, 97.0, 96.0, 96.0, 96.0, 96.0, 97.0, 97.0, 96.0], "unit": "score", "name": "imaging-desaturate", "value": 96.3}, {"lowerIsBetter": true, "replicates": [70.0, 70.0, 69.0, 69.0, 70.0, 68.0, 71.0, 69.0, 70.0, 70.0], "unit": "score", "name": "json-parse-financial", "value": 69.6}, {"lowerIsBetter": true, "replicates": [68.0, 68.0, 72.0, 69.0, 71.0, 69.0, 69.0, 69.0, 69.0, 68.0], "unit": "score", "name": "json-stringify-tinderbox", "value": 69.2}, {"lowerIsBetter": true, "replicates": [82.0, 85.0, 83.0, 85.0, 86.0, 84.0, 85.0, 84.0, 86.0, 84.0], "unit": "score", "name": "stanford-crypto-aes", "value": 84.4}, {"lowerIsBetter": true, "replicates": [123.0, 120.0, 124.0, 131.0, 123.0, 130.0, 124.0, 131.0, 124.0, 119.0], "unit": "score", "name": "stanford-crypto-ccm", "value": 124.9}, {"lowerIsBetter": true, "replicates": [145.0, 157.0, 164.0, 148.0, 151.0, 137.0, 154.0, 164.0, 151.0, 141.0], "unit": "score", "name": "stanford-crypto-pbkdf2", "value": 151.2}, {"lowerIsBetter": true, "replicates": [72.0, 72.0, 72.0, 71.0, 76.0, 69.0, 77.0, 73.0, 71.0, 74.0], "unit": "score", "name": "stanford-crypto-sha256-iterative", "value": 72.7}], "name": "kraken", "value": 1548.8000000000002}, {"lowerIsBetter": false, "subtests": [{"lowerIsBetter": false, "replicates": [167.39203213927016], "unit": "score", "name": "Richards", "value": 210.89414799999994}, {"lowerIsBetter": false, "replicates": [189.07165815844206], "unit": "score", "name": "DeltaBlue", "value": 349.698102}, {"lowerIsBetter": false, "replicates": [277.85495971103086], "unit": "score", "name": "Encrypt", "value": 957.9854189999998}, {"lowerIsBetter": false, "replicates": [5256.544502617801], "unit": "score", "name": "Decrypt", "value": 50.6380189243028}, {"lowerIsBetter": false, "replicates": [1077.5862068965516], "unit": "score", "name": "RayTrace", "value": 686.7097920000001}, {"lowerIsBetter": false, "replicates": [703.4434293745608], "unit": "score", "name": "Earley", "value": 947.4294195804194}, {"lowerIsBetter": false, "replicates": [12378.048780487805], "unit": "score", "name": "Boyer", "value": 53.842331034482775}, {"lowerIsBetter": false, "replicates": [43042.55319148936], "unit": "score", "name": "RegExp", "value": 21.16475284231339}, {"lowerIsBetter": false, "replicates": [587.0327102803739], "unit": "score", "name": "Splay", "value": 138.8184995024876}, {"lowerIsBetter": false, "replicates": [4840.579710144928], "unit": "score", "name": "NavierStokes", "value": 306.5748502994012}], "name": "v8_7", "value": 20310.50939143499}]} 16:21:58 INFO - TinderboxPrint: TalosResult: {"graphserver": {"v8_7": {"url": "http://graphs.mozilla.org/graph.html#tests=[[230,132,43]]", "result": "20310.51"}, "kraken": {"url": "http://graphs.mozilla.org/graph.html#tests=[[232,132,43]]", "result": "1548.80"}, "dromaeo_css": {"url": "http://graphs.mozilla.org/graph.html#tests=[[72,132,43]]", "result": "5961.71"}}} 16:21:58 INFO - Return code: 0 16:21:58 INFO - Validating PERFHERDER_DATA against /builds/slave/test/build/tests/talos/treeherder-schemas/performance-artifact.json 16:21:58 INFO - # TBPL SUCCESS # 16:21:58 INFO - Running post-action listener: _resource_record_post_action 16:21:58 INFO - Running post-run listener: _resource_record_post_run 16:21:59 INFO - Total resource usage - Wall time: 1237s; CPU: 13.0%; Read bytes: 8192; Write bytes: 540692480; Read time: 456; Write time: 1336120 16:21:59 INFO - install - Wall time: 16s; CPU: 21.0%; Read bytes: 4096; Write bytes: 230182912; Read time: 108; Write time: 941320 16:21:59 INFO - run-tests - Wall time: 1221s; CPU: 13.0%; Read bytes: 4096; Write bytes: 310509568; Read time: 348; Write time: 394800 16:21:59 INFO - Running post-run listener: _upload_blobber_files 16:21:59 INFO - Blob upload gear active. 16:21:59 INFO - Preparing to upload files from /builds/slave/test/build/blobber_upload_dir. 16:21:59 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 16:21:59 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'] 16:21:59 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 16:21:59 INFO - (blobuploader) - INFO - Open directory for files ... 16:21:59 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log ... 16:21:59 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 16:21:59 INFO - (blobuploader) - INFO - Uploading, attempt #1. 16:22:01 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_raw.log: uploaded 16:22:01 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 16:22:01 INFO - (blobuploader) - INFO - Done attempting. 16:22:01 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log ... 16:22:01 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 16:22:01 INFO - (blobuploader) - INFO - Uploading, attempt #1. 16:22:02 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_errorsummary.log: uploaded 16:22:02 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 16:22:02 INFO - (blobuploader) - INFO - Done attempting. 16:22:02 INFO - (blobuploader) - INFO - Iteration through files over. 16:22:02 INFO - Return code: 0 16:22:02 INFO - rmtree: /builds/slave/test/build/uploaded_files.json 16:22:02 INFO - retry: Calling remove with args: ('/builds/slave/test/build/uploaded_files.json',), kwargs: {}, attempt #1 16:22:02 INFO - Setting buildbot property blobber_files to {"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/7f5d06f0fd02c42490b3f661dba61691717a1001057719d8bf49b4c9b655125c61f2af84968a3fd7ef47f4a9960b15e9c1a5f827a05d401b24c7d59ac0ed6d67", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/05677afca0580f57035afefc5d91fd734a66e10cf037a9f230c92fcaeb8b23c6694410cd0c4e45c3ce610a294103e9cdc39587723dc66dbf0004d7c39508ef98"} 16:22:02 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test/properties/blobber_files 16:22:02 INFO - Writing to file /builds/slave/test/properties/blobber_files 16:22:02 INFO - Contents: 16:22:02 INFO - blobber_files:{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/7f5d06f0fd02c42490b3f661dba61691717a1001057719d8bf49b4c9b655125c61f2af84968a3fd7ef47f4a9960b15e9c1a5f827a05d401b24c7d59ac0ed6d67", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/05677afca0580f57035afefc5d91fd734a66e10cf037a9f230c92fcaeb8b23c6694410cd0c4e45c3ce610a294103e9cdc39587723dc66dbf0004d7c39508ef98"} 16:22:02 INFO - Running post-run listener: copy_logs_to_upload_dir 16:22:02 INFO - Copying logs to upload dir... 16:22:02 INFO - mkdir: /builds/slave/test/build/upload/logs 16:22:02 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1282.857525 ========= master_lag: 0.01 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 21 mins, 22 secs) (at 2016-01-15 16:22:02.135020) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-01-15 16:22:02.138421) ========= 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=df17445c3590ff7897617a0e00000225-1452895563.611255-1710186019 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/7f5d06f0fd02c42490b3f661dba61691717a1001057719d8bf49b4c9b655125c61f2af84968a3fd7ef47f4a9960b15e9c1a5f827a05d401b24c7d59ac0ed6d67", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/05677afca0580f57035afefc5d91fd734a66e10cf037a9f230c92fcaeb8b23c6694410cd0c4e45c3ce610a294103e9cdc39587723dc66dbf0004d7c39508ef98"} build_url:https://queue.taskcluster.net/v1/task/RxFGf-SRTH2YSbdfoAuUlQ/artifacts/public/build/firefox-46.0a1.en-US.linux-x86_64.tar.bz2 program finished with exit code 0 elapsedTime=0.011495 build_url: 'https://queue.taskcluster.net/v1/task/RxFGf-SRTH2YSbdfoAuUlQ/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/7f5d06f0fd02c42490b3f661dba61691717a1001057719d8bf49b4c9b655125c61f2af84968a3fd7ef47f4a9960b15e9c1a5f827a05d401b24c7d59ac0ed6d67", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team-Non-PGO/sha512/05677afca0580f57035afefc5d91fd734a66e10cf037a9f230c92fcaeb8b23c6694410cd0c4e45c3ce610a294103e9cdc39587723dc66dbf0004d7c39508ef98"}' ========= master_lag: 0.01 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-01-15 16:22:02.162714) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-01-15 16:22:02.163036) ========= 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=df17445c3590ff7897617a0e00000225-1452895563.611255-1710186019 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004791 ========= master_lag: 0.08 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-01-15 16:22:02.245903) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2016-01-15 16:22:02.246216) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2016-01-15 16:22:02.246490) ========= ========= Total master_lag: 0.29 =========