builder: autoland_ubuntu64_hw_test-dromaeojs-e10s slave: talos-linux64-ix-004 starttime: 1467313158.01 results: success (0) buildid: 20160630110129 builduid: 0284c96652da4f9ca2e45dd3f483c6c5 revision: 2f3a0b0aab552654bd8bc2bbfe84c8ec24023ae1 ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2016-06-30 11:59:18.010373) ========= master: http://buildbot-master105.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2016-06-30 11:59:18.010888) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-06-30 11:59:18.011454) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-06-30 11:59:18.077792) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-06-30 11:59:18.078058) ========= 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=c6927cf182745ad25b1d38b9000001fe-1467308939.208533-281882626 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2016-06-30 11:59:18-- https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py Resolving hg.mozilla.org (hg.mozilla.org)... 63.245.215.25, 63.245.215.102 Connecting to hg.mozilla.org (hg.mozilla.org)|63.245.215.25|:443... connected. HTTP request sent, awaiting response... 200 Script output follows Length: 12141 (12K) [text/x-python] Saving to: `archiver_client.py' 0K .......... . 100% 24.1M=0s 2016-06-30 11:59:18 (24.1 MB/s) - `archiver_client.py' saved [12141/12141] program finished with exit code 0 elapsedTime=0.152182 ========= master_lag: 0.04 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-06-30 11:59:18.270940) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-06-30 11:59:18.271267) ========= rm -rf scripts properties in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['rm', '-rf', 'scripts', 'properties'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=c6927cf182745ad25b1d38b9000001fe-1467308939.208533-281882626 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.019254 ========= master_lag: 0.04 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-06-30 11:59:18.330773) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-06-30 11:59:18.331082) ========= bash -c 'python archiver_client.py mozharness --repo integration/autoland --rev 2f3a0b0aab552654bd8bc2bbfe84c8ec24023ae1 --destination scripts --debug' in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', u'python archiver_client.py mozharness --repo integration/autoland --rev 2f3a0b0aab552654bd8bc2bbfe84c8ec24023ae1 --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=c6927cf182745ad25b1d38b9000001fe-1467308939.208533-281882626 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2016-06-30 11:59:18,714 truncating revision to first 12 chars 2016-06-30 11:59:18,714 Setting DEBUG logging. 2016-06-30 11:59:18,714 attempt 1/10 2016-06-30 11:59:18,714 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/integration/autoland/2f3a0b0aab55?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2016-06-30 11:59:19,018 unpacking tar archive at: autoland-2f3a0b0aab55/testing/mozharness/ program finished with exit code 0 elapsedTime=0.644017 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-06-30 11:59:18.989914) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-06-30 11:59:18.990195) ========= script_repo_revision: 2f3a0b0aab552654bd8bc2bbfe84c8ec24023ae1 ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-06-30 11:59:18.990598) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-06-30 11:59:18.990865) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-06-30 11:59:19.001636) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 57 secs) (at 2016-06-30 11:59:19.001971) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Autoland-Non-PGO --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Autoland-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', 'Autoland-Non-PGO', '--cfg', 'talos/linux_config.py', '--download-symbols', 'ondemand', '--use-talos-json', '--blob-upload-branch', 'Autoland-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=c6927cf182745ad25b1d38b9000001fe-1467308939.208533-281882626 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 11:59:19 INFO - MultiFileLogger online at 20160630 11:59:19 in /builds/slave/test 11:59:19 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Autoland-Non-PGO --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Autoland-Non-PGO 11:59:19 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 11:59:19 INFO - {'append_to_log': False, 11:59:19 INFO - 'base_work_dir': '/builds/slave/test', 11:59:19 INFO - 'blob_upload_branch': 'Autoland-Non-PGO', 11:59:19 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 11:59:19 INFO - 'branch': 'Autoland-Non-PGO', 11:59:19 INFO - 'buildbot_json_path': 'buildprops.json', 11:59:19 INFO - 'config_files': ('talos/linux_config.py',), 11:59:19 INFO - 'default_actions': ('clobber', 11:59:19 INFO - 'read-buildbot-config', 11:59:19 INFO - 'download-and-extract', 11:59:19 INFO - 'populate-webroot', 11:59:19 INFO - 'create-virtualenv', 11:59:19 INFO - 'install', 11:59:19 INFO - 'run-tests'), 11:59:19 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 11:59:19 INFO - 'download_minidump_stackwalk': True, 11:59:19 INFO - 'download_symbols': 'ondemand', 11:59:19 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 11:59:19 INFO - 'tooltool.py': '/tools/tooltool.py', 11:59:19 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 11:59:19 INFO - '/tools/misc-python/virtualenv.py')}, 11:59:19 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 11:59:19 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 11:59:19 INFO - 'installer_path': 'installer.exe', 11:59:19 INFO - 'log_level': 'info', 11:59:19 INFO - 'log_name': 'talos', 11:59:19 INFO - 'log_to_console': True, 11:59:19 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 11:59:19 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 11:59:19 INFO - 'opt_config_files': (), 11:59:19 INFO - 'pip_index': False, 11:59:19 INFO - 'sps_profile': False, 11:59:19 INFO - 'sps_profile_interval': 0, 11:59:19 INFO - 'suite': 'dromaeojs-e10s', 11:59:19 INFO - 'system_bits': '32', 11:59:19 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 11:59:19 INFO - 'title': 'talos-linux64-ix-004', 11:59:19 INFO - 'tooltool_cache': '/builds/tooltool_cache', 11:59:19 INFO - 'use_talos_json': True, 11:59:19 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 11:59:19 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 11:59:19 INFO - 'work_dir': 'build'} 11:59:19 INFO - ##### 11:59:19 INFO - ##### Running clobber step. 11:59:19 INFO - ##### 11:59:19 INFO - Running pre-action listener: _resource_record_pre_action 11:59:19 INFO - Running main action method: clobber 11:59:19 INFO - rmtree: /builds/slave/test/build 11:59:19 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 11:59:19 INFO - Running post-action listener: _resource_record_post_action 11:59:19 INFO - ##### 11:59:19 INFO - ##### Finished clobber step (success) 11:59:19 INFO - ##### 11:59:19 INFO - ##### 11:59:19 INFO - ##### Running read-buildbot-config step. 11:59:19 INFO - ##### 11:59:19 INFO - Running pre-action listener: _resource_record_pre_action 11:59:19 INFO - Running main action method: read_buildbot_config 11:59:19 INFO - Using buildbot properties: 11:59:19 INFO - { 11:59:19 INFO - "project": "", 11:59:19 INFO - "product": "firefox", 11:59:19 INFO - "script_repo_revision": "production", 11:59:19 INFO - "builddir": "autoland_ubuntu64_hw_test-dromaeojs-e10s", 11:59:19 INFO - "repository": "", 11:59:19 INFO - "buildername": "Ubuntu HW 12.04 x64 autoland talos dromaeojs-e10s", 11:59:19 INFO - "buildid": "20160630110129", 11:59:19 INFO - "pgo_build": "False", 11:59:19 INFO - "basedir": "/builds/slave/test", 11:59:19 INFO - "buildnumber": 25, 11:59:19 INFO - "slavename": "talos-linux64-ix-004", 11:59:19 INFO - "master": "http://buildbot-master105.bb.releng.scl3.mozilla.com:8201/", 11:59:19 INFO - "platform": "ubuntu64_hw", 11:59:19 INFO - "scheduler": "tests-autoland-linux64-talos", 11:59:19 INFO - "branch": "autoland", 11:59:19 INFO - "repo_path": "integration/autoland", 11:59:19 INFO - "revision": "2f3a0b0aab552654bd8bc2bbfe84c8ec24023ae1", 11:59:19 INFO - "stage_platform": "linux64", 11:59:19 INFO - "builduid": "0284c96652da4f9ca2e45dd3f483c6c5", 11:59:19 INFO - "slavebuilddir": "test" 11:59:19 INFO - } 11:59:19 INFO - Found installer url https://queue.taskcluster.net/v1/task/UOlgP3uLQCa0cXZY2usHCA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2. 11:59:19 INFO - Running post-action listener: _resource_record_post_action 11:59:19 INFO - ##### 11:59:19 INFO - ##### Finished read-buildbot-config step (success) 11:59:19 INFO - ##### 11:59:19 INFO - ##### 11:59:19 INFO - ##### Running download-and-extract step. 11:59:19 INFO - ##### 11:59:19 INFO - Running pre-action listener: _resource_record_pre_action 11:59:19 INFO - Running main action method: download_and_extract 11:59:19 INFO - mkdir: /builds/slave/test/build/tests 11:59:19 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')]} 11:59:19 INFO - https://queue.taskcluster.net/v1/task/UOlgP3uLQCa0cXZY2usHCA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.test_packages.json matches https://queue.taskcluster.net 11:59:19 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/UOlgP3uLQCa0cXZY2usHCA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.test_packages.json 11:59:19 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/UOlgP3uLQCa0cXZY2usHCA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.test_packages.json 11:59:19 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/UOlgP3uLQCa0cXZY2usHCA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.test_packages.json to /builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.test_packages.json 11:59:19 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/UOlgP3uLQCa0cXZY2usHCA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.test_packages.json', 'file_name': '/builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.test_packages.json'}, attempt #1 11:59:31 INFO - Downloaded 1361 bytes. 11:59:31 INFO - Reading from file /builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.test_packages.json 11:59:31 INFO - Using the following test package requirements: 11:59:31 INFO - {u'common': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip'], 11:59:31 INFO - u'cppunittest': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 11:59:31 INFO - u'firefox-50.0a1.en-US.linux-x86_64.cppunittest.tests.zip'], 11:59:31 INFO - u'gtest': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 11:59:31 INFO - u'firefox-50.0a1.en-US.linux-x86_64.gtest.tests.zip'], 11:59:31 INFO - u'jittest': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 11:59:31 INFO - u'jsshell-linux-x86_64.zip'], 11:59:31 INFO - u'mochitest': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 11:59:31 INFO - u'firefox-50.0a1.en-US.linux-x86_64.mochitest.tests.zip'], 11:59:31 INFO - u'mozbase': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip'], 11:59:31 INFO - u'reftest': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 11:59:31 INFO - u'firefox-50.0a1.en-US.linux-x86_64.reftest.tests.zip'], 11:59:31 INFO - u'talos': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 11:59:31 INFO - u'firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip'], 11:59:31 INFO - u'web-platform': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 11:59:31 INFO - u'firefox-50.0a1.en-US.linux-x86_64.web-platform.tests.zip'], 11:59:31 INFO - u'xpcshell': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 11:59:31 INFO - u'firefox-50.0a1.en-US.linux-x86_64.xpcshell.tests.zip']} 11:59:31 INFO - Downloading packages: [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip'] for test suite category: common 11:59:31 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 11:59:31 INFO - https://queue.taskcluster.net/v1/task/UOlgP3uLQCa0cXZY2usHCA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 11:59:31 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/UOlgP3uLQCa0cXZY2usHCA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip 11:59:31 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/UOlgP3uLQCa0cXZY2usHCA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip 11:59:31 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/UOlgP3uLQCa0cXZY2usHCA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip to /builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip 11:59:31 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/UOlgP3uLQCa0cXZY2usHCA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip'}, attempt #1 11:59:34 INFO - Downloaded 22701821 bytes. 11:59:34 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', '-d', '/builds/slave/test/build/tests'] 11:59:34 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip -d /builds/slave/test/build/tests 11:59:35 INFO - Return code: 0 11:59:35 INFO - Downloading packages: [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', u'firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip'] for test suite category: talos 11:59:35 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 11:59:35 INFO - https://queue.taskcluster.net/v1/task/UOlgP3uLQCa0cXZY2usHCA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 11:59:35 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/UOlgP3uLQCa0cXZY2usHCA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip 11:59:35 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/UOlgP3uLQCa0cXZY2usHCA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip 11:59:35 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/UOlgP3uLQCa0cXZY2usHCA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip to /builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip 11:59:35 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/UOlgP3uLQCa0cXZY2usHCA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip'}, attempt #1 11:59:44 INFO - Downloaded 22701821 bytes. 11:59:44 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', '-d', '/builds/slave/test/build/tests'] 11:59:44 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip -d /builds/slave/test/build/tests 11:59:46 INFO - Return code: 0 11:59:46 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 11:59:46 INFO - https://queue.taskcluster.net/v1/task/UOlgP3uLQCa0cXZY2usHCA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip matches https://queue.taskcluster.net 11:59:46 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/UOlgP3uLQCa0cXZY2usHCA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip 11:59:46 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/UOlgP3uLQCa0cXZY2usHCA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip 11:59:46 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/UOlgP3uLQCa0cXZY2usHCA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip to /builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip 11:59:46 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/UOlgP3uLQCa0cXZY2usHCA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip'}, attempt #1 11:59:48 INFO - Downloaded 14405242 bytes. 11:59:48 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip', '-d', '/builds/slave/test/build/tests'] 11:59:48 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip -d /builds/slave/test/build/tests 11:59:49 INFO - Return code: 0 11:59:49 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 11:59:49 INFO - https://queue.taskcluster.net/v1/task/UOlgP3uLQCa0cXZY2usHCA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 matches https://queue.taskcluster.net 11:59:49 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/UOlgP3uLQCa0cXZY2usHCA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 11:59:49 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/UOlgP3uLQCa0cXZY2usHCA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 11:59:49 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/UOlgP3uLQCa0cXZY2usHCA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 to /builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 11:59:49 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/UOlgP3uLQCa0cXZY2usHCA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2', 'file_name': '/builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2'}, attempt #1 11:59:50 INFO - Downloaded 56453192 bytes. 11:59:50 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/UOlgP3uLQCa0cXZY2usHCA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 11:59:50 INFO - mkdir: /builds/slave/test/properties 11:59:50 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 11:59:50 INFO - Writing to file /builds/slave/test/properties/build_url 11:59:50 INFO - Contents: 11:59:50 INFO - build_url:https://queue.taskcluster.net/v1/task/UOlgP3uLQCa0cXZY2usHCA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 11:59:51 INFO - Running post-action listener: _resource_record_post_action 11:59:51 INFO - Running post-action listener: set_extra_try_arguments 11:59:51 INFO - ##### 11:59:51 INFO - ##### Finished download-and-extract step (success) 11:59:51 INFO - ##### 11:59:51 INFO - ##### 11:59:51 INFO - ##### Running populate-webroot step. 11:59:51 INFO - ##### 11:59:51 INFO - Running pre-action listener: _resource_record_pre_action 11:59:51 INFO - Running main action method: populate_webroot 11:59:51 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 11:59:51 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 11:59:51 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 11:59:51 INFO - '--tppagecycles', 11:59:51 INFO - '7'], 11:59:51 INFO - 'tests': ['tsvgm']}}, 11:59:51 INFO - 'suites': {'chromez': {'talos_options': ['--disable-e10s'], 11:59:51 INFO - 'tests': ['tresize', 'tcanvasmark']}, 11:59:51 INFO - 'chromez-e10s': {'tests': ['tresize', 'tcanvasmark']}, 11:59:51 INFO - 'dromaeojs': {'talos_options': ['--disable-e10s'], 11:59:51 INFO - 'tests': ['dromaeo_css', 'kraken']}, 11:59:51 INFO - 'dromaeojs-e10s': {'tests': ['dromaeo_css', 'kraken']}, 11:59:51 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 11:59:51 INFO - 'talos_options': ['--disable-e10s'], 11:59:51 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 11:59:51 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 11:59:51 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 11:59:51 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 11:59:51 INFO - 'talos_options': ['--disable-e10s'], 11:59:51 INFO - 'tests': ['damp', 'tps']}, 11:59:51 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 11:59:51 INFO - 'tests': ['damp', 'tps']}, 11:59:51 INFO - 'g3': {'talos_options': ['--disable-e10s'], 11:59:51 INFO - 'tests': ['dromaeo_dom']}, 11:59:51 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 11:59:51 INFO - 'g4': {'talos_options': ['--disable-e10s'], 11:59:51 INFO - 'tests': ['basic_compositor_video']}, 11:59:51 INFO - 'g4-e10s': {'tests': ['basic_compositor_video']}, 11:59:51 INFO - 'other': {'talos_options': ['--disable-e10s'], 11:59:51 INFO - 'tests': ['a11yr', 11:59:51 INFO - 'ts_paint', 11:59:51 INFO - 'tpaint', 11:59:51 INFO - 'sessionrestore', 11:59:51 INFO - 'sessionrestore_no_auto_restore', 11:59:51 INFO - 'tabpaint']}, 11:59:51 INFO - 'other-e10s': {'tests': ['a11yr', 11:59:51 INFO - 'ts_paint', 11:59:51 INFO - 'tpaint', 11:59:51 INFO - 'sessionrestore', 11:59:51 INFO - 'sessionrestore_no_auto_restore', 11:59:51 INFO - 'tabpaint']}, 11:59:51 INFO - 'other-e10s_l64': {'tests': ['a11yr', 11:59:51 INFO - 'ts_paint', 11:59:51 INFO - 'tpaint', 11:59:51 INFO - 'sessionrestore', 11:59:51 INFO - 'sessionrestore_no_auto_restore', 11:59:51 INFO - 'tabpaint']}, 11:59:51 INFO - 'other-e10s_nol64': {'tests': ['a11yr', 11:59:51 INFO - 'ts_paint', 11:59:51 INFO - 'tpaint', 11:59:51 INFO - 'sessionrestore', 11:59:51 INFO - 'sessionrestore_no_auto_restore', 11:59:51 INFO - 'tabpaint']}, 11:59:51 INFO - 'other_l64': {'talos_options': ['--disable-e10s'], 11:59:51 INFO - 'tests': ['a11yr', 11:59:51 INFO - 'ts_paint', 11:59:51 INFO - 'tpaint', 11:59:51 INFO - 'sessionrestore', 11:59:51 INFO - 'sessionrestore_no_auto_restore', 11:59:51 INFO - 'tabpaint']}, 11:59:51 INFO - 'other_nol64': {'talos_options': ['--disable-e10s'], 11:59:51 INFO - 'tests': ['a11yr', 11:59:51 INFO - 'ts_paint', 11:59:51 INFO - 'tpaint', 11:59:51 INFO - 'sessionrestore', 11:59:51 INFO - 'sessionrestore_no_auto_restore', 11:59:51 INFO - 'tabpaint']}, 11:59:51 INFO - 'svgr': {'talos_options': ['--disable-e10s'], 11:59:51 INFO - 'tests': ['tsvgx', 11:59:51 INFO - 'tsvgr_opacity', 11:59:51 INFO - 'tart', 11:59:51 INFO - 'tscrollx', 11:59:51 INFO - 'cart']}, 11:59:51 INFO - 'svgr-e10s': {'tests': ['tsvgx', 11:59:51 INFO - 'tsvgr_opacity', 11:59:51 INFO - 'tart', 11:59:51 INFO - 'tscrollx', 11:59:51 INFO - 'cart']}, 11:59:51 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 11:59:51 INFO - 'talos_options': ['--disable-e10s'], 11:59:51 INFO - 'tests': ['tp5o']}, 11:59:51 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 11:59:51 INFO - 'tests': ['tp5o']}, 11:59:51 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 11:59:51 INFO - 'talos_options': ['--disable-e10s', 11:59:51 INFO - '--xperf_path', 11:59:51 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 11:59:51 INFO - 'tests': ['tp5n']}, 11:59:51 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 11:59:51 INFO - 'talos_options': ['--xperf_path', 11:59:51 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 11:59:51 INFO - 'tests': ['tp5n']}}, 11:59:51 INFO - 'talos.zip': {'path': '', 11:59:51 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 11:59:51 INFO - Running post-action listener: _resource_record_post_action 11:59:51 INFO - ##### 11:59:51 INFO - ##### Finished populate-webroot step (success) 11:59:51 INFO - ##### 11:59:51 INFO - ##### 11:59:51 INFO - ##### Running create-virtualenv step. 11:59:51 INFO - ##### 11:59:51 INFO - Running pre-action listener: _resource_record_pre_action 11:59:51 INFO - Running main action method: create_virtualenv 11:59:51 INFO - Creating virtualenv /builds/slave/test/build/venv 11:59:51 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 11:59:51 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 11:59:51 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 11:59:51 INFO - Using real prefix '/usr' 11:59:51 INFO - New python executable in /builds/slave/test/build/venv/bin/python 11:59:51 INFO - Installing distribute.............................................................................................................................................................................................done. 11:59:53 INFO - Installing pip.................done. 11:59:53 INFO - Return code: 0 11:59:53 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 11:59: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')]} 11:59:53 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 11:59:53 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:59: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')]} 11:59:53 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 11:59:53 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:59:53 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'pip>=1.5']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x213d030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x22a08a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x236c400>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x23fb570>, '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 0x23fc470>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x23fc900>, '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': 'c6927cf182745ad25b1d38b9000001fe-1467308939.208533-281882626', '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 11:59:53 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'pip>=1.5'] in /builds/slave/test/build 11:59:53 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub pip>=1.5 11:59:53 INFO - Using env: {'DISPLAY': ':0', 11:59:53 INFO - 'HOME': '/home/cltbld', 11:59:53 INFO - 'LANG': 'en_US.UTF-8', 11:59:53 INFO - 'LANGUAGE': 'en_US:en', 11:59:53 INFO - 'LOGNAME': 'cltbld', 11:59:53 INFO - 'MAIL': '/var/mail/cltbld', 11:59:53 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 11:59:53 INFO - 'MOZ_NO_REMOTE': '1', 11:59:53 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 11:59:53 INFO - 'NO_EM_RESTART': '1', 11:59:53 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 11:59:53 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 11:59:53 INFO - 'PWD': '/builds/slave/test', 11:59:53 INFO - 'SHELL': '/bin/bash', 11:59:53 INFO - 'SHLVL': '1', 11:59:53 INFO - 'TERM': 'linux', 11:59:53 INFO - 'TMOUT': '86400', 11:59:53 INFO - 'USER': 'cltbld', 11:59:53 INFO - 'XDG_SESSION_COOKIE': 'c6927cf182745ad25b1d38b9000001fe-1467308939.208533-281882626', 11:59:53 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 11:59:53 INFO - '_': '/tools/buildbot/bin/python'} 11:59:53 INFO - Ignoring indexes: https://pypi.python.org/simple/ 11:59:53 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 11:59:53 INFO - Cleaning up... 11:59:53 INFO - Return code: 0 11:59:53 INFO - Installing psutil>=3.1.1 into virtualenv /builds/slave/test/build/venv 11:59: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')]} 11:59:53 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 11:59:53 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:59: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')]} 11:59:53 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 11:59:53 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:59:53 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'psutil>=3.1.1']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x213d030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x22a08a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x236c400>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x23fb570>, '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 0x23fc470>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x23fc900>, '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': 'c6927cf182745ad25b1d38b9000001fe-1467308939.208533-281882626', '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 11:59:53 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'psutil>=3.1.1'] in /builds/slave/test/build 11:59:53 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub psutil>=3.1.1 11:59:53 INFO - Using env: {'DISPLAY': ':0', 11:59:53 INFO - 'HOME': '/home/cltbld', 11:59:53 INFO - 'LANG': 'en_US.UTF-8', 11:59:53 INFO - 'LANGUAGE': 'en_US:en', 11:59:53 INFO - 'LOGNAME': 'cltbld', 11:59:53 INFO - 'MAIL': '/var/mail/cltbld', 11:59:53 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 11:59:53 INFO - 'MOZ_NO_REMOTE': '1', 11:59:53 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 11:59:53 INFO - 'NO_EM_RESTART': '1', 11:59:53 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 11:59:53 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 11:59:53 INFO - 'PWD': '/builds/slave/test', 11:59:53 INFO - 'SHELL': '/bin/bash', 11:59:53 INFO - 'SHLVL': '1', 11:59:53 INFO - 'TERM': 'linux', 11:59:53 INFO - 'TMOUT': '86400', 11:59:53 INFO - 'USER': 'cltbld', 11:59:53 INFO - 'XDG_SESSION_COOKIE': 'c6927cf182745ad25b1d38b9000001fe-1467308939.208533-281882626', 11:59:53 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 11:59:53 INFO - '_': '/tools/buildbot/bin/python'} 11:59:54 INFO - Ignoring indexes: https://pypi.python.org/simple/ 11:59:54 INFO - Downloading/unpacking psutil>=3.1.1 11:59:54 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 11:59:54 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 11:59:54 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 11:59:54 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 11:59:54 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 11:59:54 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 11:59:56 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 11:59:56 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 11:59:56 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 11:59:56 INFO - Installing collected packages: psutil 11:59:56 INFO - Running setup.py install for psutil 11:59:56 INFO - building 'psutil._psutil_linux' extension 11:59:56 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 11:59:56 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 11:59:56 INFO - building 'psutil._psutil_posix' extension 11:59:56 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 11:59:56 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 11:59:56 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 11:59:56 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 11:59:56 INFO - Successfully installed psutil 11:59:56 INFO - Cleaning up... 11:59:56 INFO - Return code: 0 11:59:56 INFO - Installing mozsystemmonitor==0.3 into virtualenv /builds/slave/test/build/venv 11:59:56 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')]} 11:59:56 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 11:59:56 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:59:56 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')]} 11:59:56 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 11:59:56 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:59:56 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'mozsystemmonitor==0.3']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x213d030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x22a08a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x236c400>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x23fb570>, '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 0x23fc470>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x23fc900>, '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': 'c6927cf182745ad25b1d38b9000001fe-1467308939.208533-281882626', '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 11:59:56 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'mozsystemmonitor==0.3'] in /builds/slave/test/build 11:59:56 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub mozsystemmonitor==0.3 11:59:56 INFO - Using env: {'DISPLAY': ':0', 11:59:56 INFO - 'HOME': '/home/cltbld', 11:59:56 INFO - 'LANG': 'en_US.UTF-8', 11:59:56 INFO - 'LANGUAGE': 'en_US:en', 11:59:56 INFO - 'LOGNAME': 'cltbld', 11:59:56 INFO - 'MAIL': '/var/mail/cltbld', 11:59:56 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 11:59:56 INFO - 'MOZ_NO_REMOTE': '1', 11:59:56 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 11:59:56 INFO - 'NO_EM_RESTART': '1', 11:59:56 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 11:59:56 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 11:59:56 INFO - 'PWD': '/builds/slave/test', 11:59:56 INFO - 'SHELL': '/bin/bash', 11:59:56 INFO - 'SHLVL': '1', 11:59:56 INFO - 'TERM': 'linux', 11:59:56 INFO - 'TMOUT': '86400', 11:59:56 INFO - 'USER': 'cltbld', 11:59:56 INFO - 'XDG_SESSION_COOKIE': 'c6927cf182745ad25b1d38b9000001fe-1467308939.208533-281882626', 11:59:56 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 11:59:56 INFO - '_': '/tools/buildbot/bin/python'} 11:59:56 INFO - Ignoring indexes: https://pypi.python.org/simple/ 11:59:56 INFO - Downloading/unpacking mozsystemmonitor==0.3 11:59:56 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 11:59:56 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 11:59:56 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 11:59:56 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 11:59:56 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 11:59:56 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 11:59:58 INFO - Downloading mozsystemmonitor-0.3.tar.gz 11:59:58 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 11:59:58 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.3) 11:59:58 INFO - Installing collected packages: mozsystemmonitor 11:59:58 INFO - Running setup.py install for mozsystemmonitor 11:59:58 INFO - Successfully installed mozsystemmonitor 11:59:58 INFO - Cleaning up... 11:59:59 INFO - Return code: 0 11:59:59 INFO - Installing jsonschema==2.5.1 into virtualenv /builds/slave/test/build/venv 11:59:59 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 11:59:59 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 11:59:59 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:59:59 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 11:59:59 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 11:59:59 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 11:59:59 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema==2.5.1']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x213d030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x22a08a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x236c400>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x23fb570>, '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 0x23fc470>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x23fc900>, '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': 'c6927cf182745ad25b1d38b9000001fe-1467308939.208533-281882626', '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 11:59:59 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema==2.5.1'] in /builds/slave/test/build 11:59:59 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub jsonschema==2.5.1 11:59:59 INFO - Using env: {'DISPLAY': ':0', 11:59:59 INFO - 'HOME': '/home/cltbld', 11:59:59 INFO - 'LANG': 'en_US.UTF-8', 11:59:59 INFO - 'LANGUAGE': 'en_US:en', 11:59:59 INFO - 'LOGNAME': 'cltbld', 11:59:59 INFO - 'MAIL': '/var/mail/cltbld', 11:59:59 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 11:59:59 INFO - 'MOZ_NO_REMOTE': '1', 11:59:59 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 11:59:59 INFO - 'NO_EM_RESTART': '1', 11:59:59 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 11:59:59 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 11:59:59 INFO - 'PWD': '/builds/slave/test', 11:59:59 INFO - 'SHELL': '/bin/bash', 11:59:59 INFO - 'SHLVL': '1', 11:59:59 INFO - 'TERM': 'linux', 11:59:59 INFO - 'TMOUT': '86400', 11:59:59 INFO - 'USER': 'cltbld', 11:59:59 INFO - 'XDG_SESSION_COOKIE': 'c6927cf182745ad25b1d38b9000001fe-1467308939.208533-281882626', 11:59:59 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 11:59:59 INFO - '_': '/tools/buildbot/bin/python'} 11:59:59 INFO - Ignoring indexes: https://pypi.python.org/simple/ 11:59:59 INFO - Downloading/unpacking jsonschema==2.5.1 11:59:59 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 11:59:59 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 11:59:59 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 11:59:59 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 11:59:59 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 11:59:59 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 12:00:01 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 12:00:01 INFO - Downloading/unpacking functools32 (from jsonschema==2.5.1) 12:00:01 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 12:00:01 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 12:00:01 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 12:00:01 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 12:00:01 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 12:00:01 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 12:00:01 INFO - Downloading functools32-3.2.3-2.tar.gz 12:00:01 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/functools32/setup.py) egg_info for package functools32 12:00:01 INFO - warning: no files found matching '*.txt' 12:00:01 INFO - no previously-included directories found matching 'build' 12:00:01 INFO - no previously-included directories found matching 'dist' 12:00:01 INFO - no previously-included directories found matching '.git*' 12:00:01 INFO - Installing collected packages: jsonschema, functools32 12:00:01 INFO - Running setup.py install for functools32 12:00:01 INFO - warning: no files found matching '*.txt' 12:00:01 INFO - no previously-included directories found matching 'build' 12:00:01 INFO - no previously-included directories found matching 'dist' 12:00:01 INFO - no previously-included directories found matching '.git*' 12:00:01 INFO - Successfully installed jsonschema functools32 12:00:01 INFO - Cleaning up... 12:00:01 INFO - Return code: 0 12:00:01 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 12:00:01 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 12:00:01 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 12:00:01 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:00:01 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 12:00:01 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 12:00:01 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:00:01 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', '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 0x213d030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x22a08a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x236c400>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x23fb570>, '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 0x23fc470>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x23fc900>, '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': 'c6927cf182745ad25b1d38b9000001fe-1467308939.208533-281882626', '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 12:00:01 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'blobuploader==1.2.4'] in /builds/slave/test/build 12:00:01 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub blobuploader==1.2.4 12:00:01 INFO - Using env: {'DISPLAY': ':0', 12:00:01 INFO - 'HOME': '/home/cltbld', 12:00:01 INFO - 'LANG': 'en_US.UTF-8', 12:00:01 INFO - 'LANGUAGE': 'en_US:en', 12:00:01 INFO - 'LOGNAME': 'cltbld', 12:00:01 INFO - 'MAIL': '/var/mail/cltbld', 12:00:01 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 12:00:01 INFO - 'MOZ_NO_REMOTE': '1', 12:00:01 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 12:00:01 INFO - 'NO_EM_RESTART': '1', 12:00:01 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 12:00:01 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 12:00:01 INFO - 'PWD': '/builds/slave/test', 12:00:01 INFO - 'SHELL': '/bin/bash', 12:00:01 INFO - 'SHLVL': '1', 12:00:01 INFO - 'TERM': 'linux', 12:00:01 INFO - 'TMOUT': '86400', 12:00:01 INFO - 'USER': 'cltbld', 12:00:01 INFO - 'XDG_SESSION_COOKIE': 'c6927cf182745ad25b1d38b9000001fe-1467308939.208533-281882626', 12:00:01 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 12:00:01 INFO - '_': '/tools/buildbot/bin/python'} 12:00:01 INFO - Ignoring indexes: https://pypi.python.org/simple/ 12:00:01 INFO - Downloading/unpacking blobuploader==1.2.4 12:00:01 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 12:00:01 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 12:00:01 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 12:00:01 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 12:00:01 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 12:00:01 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 12:00:03 INFO - Downloading blobuploader-1.2.4.tar.gz 12:00:03 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 12:00:03 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 12:00: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 12:00: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 12:00: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 12:00: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 12:00: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 12:00: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 12:00:04 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 12:00:04 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 12:00:04 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 12:00:04 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 12:00:04 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 12:00:04 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 12:00:04 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 12:00:04 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 12:00:04 INFO - Downloading docopt-0.6.1.tar.gz 12:00:04 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 12:00:04 INFO - Installing collected packages: blobuploader, requests, docopt 12:00:04 INFO - Running setup.py install for blobuploader 12:00:04 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 12:00:04 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 12:00:04 INFO - Running setup.py install for requests 12:00:04 INFO - Running setup.py install for docopt 12:00:04 INFO - Successfully installed blobuploader requests docopt 12:00:04 INFO - Cleaning up... 12:00:05 INFO - Return code: 0 12:00:05 INFO - Installing None into virtualenv /builds/slave/test/build/venv 12:00: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')]} 12:00:05 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 12:00:05 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:00: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')]} 12:00:05 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 12:00:05 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:00:05 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--no-deps', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x213d030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x22a08a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x236c400>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x23fb570>, '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 0x23fc470>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x23fc900>, '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': 'c6927cf182745ad25b1d38b9000001fe-1467308939.208533-281882626', '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 12:00:05 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--no-deps', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test/build/tests/config 12:00:05 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --no-deps --timeout 120 -r /builds/slave/test/build/tests/config/mozbase_requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 12:00:05 INFO - Using env: {'DISPLAY': ':0', 12:00:05 INFO - 'HOME': '/home/cltbld', 12:00:05 INFO - 'LANG': 'en_US.UTF-8', 12:00:05 INFO - 'LANGUAGE': 'en_US:en', 12:00:05 INFO - 'LOGNAME': 'cltbld', 12:00:05 INFO - 'MAIL': '/var/mail/cltbld', 12:00:05 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 12:00:05 INFO - 'MOZ_NO_REMOTE': '1', 12:00:05 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 12:00:05 INFO - 'NO_EM_RESTART': '1', 12:00:05 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 12:00:05 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 12:00:05 INFO - 'PWD': '/builds/slave/test', 12:00:05 INFO - 'SHELL': '/bin/bash', 12:00:05 INFO - 'SHLVL': '1', 12:00:05 INFO - 'TERM': 'linux', 12:00:05 INFO - 'TMOUT': '86400', 12:00:05 INFO - 'USER': 'cltbld', 12:00:05 INFO - 'XDG_SESSION_COOKIE': 'c6927cf182745ad25b1d38b9000001fe-1467308939.208533-281882626', 12:00:05 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 12:00:05 INFO - '_': '/tools/buildbot/bin/python'} 12:00:05 INFO - Ignoring indexes: https://pypi.python.org/simple/ 12:00:05 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 12:00:05 INFO - Running setup.py (path:/tmp/pip-zIGvyq-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 12:00:05 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 12:00:05 INFO - Running setup.py (path:/tmp/pip-t1avB5-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 12:00:05 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 12:00:05 INFO - Running setup.py (path:/tmp/pip-jbjm8v-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 12:00:05 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 12:00:05 INFO - Running setup.py (path:/tmp/pip-XM2GJO-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 12:00:05 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 12:00:05 INFO - Running setup.py (path:/tmp/pip-OyN8ZP-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 12:00:05 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 12:00:05 INFO - Running setup.py (path:/tmp/pip-RDWrh3-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 12:00:05 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 12:00:05 INFO - Running setup.py (path:/tmp/pip-299fGY-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 12:00:05 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 12:00:05 INFO - Running setup.py (path:/tmp/pip-wT7FtY-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 12:00:05 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 12:00:05 INFO - Running setup.py (path:/tmp/pip-aLUpg3-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 12:00:05 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 12:00:05 INFO - Running setup.py (path:/tmp/pip-dW42gk-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 12:00:06 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 12:00:06 INFO - Running setup.py (path:/tmp/pip-TkLnjw-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 12:00:06 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 12:00:06 INFO - Running setup.py (path:/tmp/pip-SKGyLj-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 12:00:06 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 12:00:06 INFO - Running setup.py (path:/tmp/pip-C2QTAG-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 12:00:06 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 12:00:06 INFO - Running setup.py (path:/tmp/pip-9RNq_0-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 12:00:06 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 12:00:06 INFO - Running setup.py (path:/tmp/pip-GxKyXv-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 12:00:06 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 12:00:06 INFO - Running setup.py (path:/tmp/pip-WMwPMJ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 12:00:06 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 12:00:06 INFO - Running setup.py (path:/tmp/pip-q1ejnJ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 12:00:06 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 12:00:06 INFO - Running setup.py install for manifestparser 12:00:06 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 12:00:06 INFO - Running setup.py install for mozcrash 12:00:06 INFO - Running setup.py install for mozdebug 12:00:06 INFO - Running setup.py install for mozdevice 12:00:06 INFO - Installing sutini script to /builds/slave/test/build/venv/bin 12:00:06 INFO - Installing dm script to /builds/slave/test/build/venv/bin 12:00:06 INFO - Running setup.py install for mozfile 12:00:07 INFO - Running setup.py install for mozhttpd 12:00:07 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 12:00:07 INFO - Running setup.py install for mozinfo 12:00:07 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 12:00:07 INFO - Running setup.py install for mozInstall 12:00:07 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 12:00:07 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 12:00:07 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 12:00:07 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 12:00:07 INFO - Running setup.py install for mozleak 12:00:07 INFO - Running setup.py install for mozlog 12:00:07 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 12:00:07 INFO - Running setup.py install for moznetwork 12:00:07 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 12:00:07 INFO - Running setup.py install for mozprocess 12:00:07 INFO - Running setup.py install for mozprofile 12:00:07 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 12:00:07 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 12:00:07 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 12:00:07 INFO - Running setup.py install for mozrunner 12:00:07 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 12:00:08 INFO - Running setup.py install for mozscreenshot 12:00:08 INFO - Running setup.py install for moztest 12:00:08 INFO - Running setup.py install for mozversion 12:00:08 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 12:00:08 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 12:00:08 INFO - Cleaning up... 12:00:08 INFO - Return code: 0 12:00:08 INFO - Installing None into virtualenv /builds/slave/test/build/venv 12:00: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')]} 12:00:08 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 12:00:08 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:00: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')]} 12:00:08 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 12:00:08 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:00:08 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x213d030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x22a08a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x236c400>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x23fb570>, '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 0x23fc470>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x23fc900>, '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': 'c6927cf182745ad25b1d38b9000001fe-1467308939.208533-281882626', '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 12:00:08 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test/build/tests/config 12:00:08 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 -r /builds/slave/test/build/tests/config/mozbase_requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 12:00:08 INFO - Using env: {'DISPLAY': ':0', 12:00:08 INFO - 'HOME': '/home/cltbld', 12:00:08 INFO - 'LANG': 'en_US.UTF-8', 12:00:08 INFO - 'LANGUAGE': 'en_US:en', 12:00:08 INFO - 'LOGNAME': 'cltbld', 12:00:08 INFO - 'MAIL': '/var/mail/cltbld', 12:00:08 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 12:00:08 INFO - 'MOZ_NO_REMOTE': '1', 12:00:08 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 12:00:08 INFO - 'NO_EM_RESTART': '1', 12:00:08 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 12:00:08 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 12:00:08 INFO - 'PWD': '/builds/slave/test', 12:00:08 INFO - 'SHELL': '/bin/bash', 12:00:08 INFO - 'SHLVL': '1', 12:00:08 INFO - 'TERM': 'linux', 12:00:08 INFO - 'TMOUT': '86400', 12:00:08 INFO - 'USER': 'cltbld', 12:00:08 INFO - 'XDG_SESSION_COOKIE': 'c6927cf182745ad25b1d38b9000001fe-1467308939.208533-281882626', 12:00:08 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 12:00:08 INFO - '_': '/tools/buildbot/bin/python'} 12:00:08 INFO - Ignoring indexes: https://pypi.python.org/simple/ 12:00:08 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 12:00:08 INFO - Running setup.py (path:/tmp/pip-eTK3d1-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 12:00:08 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)) 12:00:08 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 12:00:08 INFO - Running setup.py (path:/tmp/pip-hDW2FF-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 12:00:08 INFO - Requirement already satisfied (use --upgrade to upgrade): mozcrash==0.17 from file:///builds/slave/test/build/tests/mozbase/mozcrash in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 12:00:08 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 12:00:08 INFO - Running setup.py (path:/tmp/pip-1jLYCn-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 12:00:08 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)) 12:00:08 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 12:00:08 INFO - Running setup.py (path:/tmp/pip-8CKFnq-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 12:00:08 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)) 12:00:08 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 12:00:08 INFO - Running setup.py (path:/tmp/pip-GcCvXs-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 12:00:08 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)) 12:00:08 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 12:00:08 INFO - Running setup.py (path:/tmp/pip-LjKao7-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 12:00:08 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)) 12:00:08 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 12:00:08 INFO - Running setup.py (path:/tmp/pip-bjjRHT-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 12:00:09 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)) 12:00:09 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 12:00:09 INFO - Running setup.py (path:/tmp/pip-oqS78X-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 12:00:09 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)) 12:00:09 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 12:00:09 INFO - Running setup.py (path:/tmp/pip-MzKb9Y-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 12:00:09 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)) 12:00:09 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 12:00:09 INFO - Running setup.py (path:/tmp/pip-E1S1rA-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 12:00:09 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog==3.2 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)) 12:00:09 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 12:00:09 INFO - Running setup.py (path:/tmp/pip-PbNdES-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 12:00:09 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)) 12:00:09 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 12:00:09 INFO - Running setup.py (path:/tmp/pip-QWnzJq-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 12:00:09 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)) 12:00:09 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 12:00:09 INFO - Running setup.py (path:/tmp/pip-5u5JaE-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 12:00:09 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)) 12:00:09 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 12:00:09 INFO - Running setup.py (path:/tmp/pip-oTQNgS-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 12:00:09 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)) 12:00:09 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 12:00:09 INFO - Running setup.py (path:/tmp/pip-qtTZ5U-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 12:00:09 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)) 12:00:09 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 12:00:09 INFO - Running setup.py (path:/tmp/pip-w_AmGh-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 12:00:09 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)) 12:00:09 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 12:00:09 INFO - Running setup.py (path:/tmp/pip-fAFAxQ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 12:00:09 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)) 12:00:09 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile>=1.0 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozcrash==0.17->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 12:00:09 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog>=3.0 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozcrash==0.17->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 12:00:09 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)) 12:00:09 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)) 12:00:09 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)) 12:00:09 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.2->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 12:00:09 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 12:00:09 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 12:00:09 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 12:00:09 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 12:00:09 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 12:00:09 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 12:00:11 INFO - Downloading blessings-1.6.tar.gz 12:00:11 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 12:00:11 INFO - Installing collected packages: blessings 12:00:11 INFO - Running setup.py install for blessings 12:00:11 INFO - Successfully installed blessings 12:00:11 INFO - Cleaning up... 12:00:11 INFO - Return code: 0 12:00:11 INFO - Done creating virtualenv /builds/slave/test/build/venv. 12:00:11 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 12:00:11 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 12:00:12 INFO - Reading from file tmpfile_stdout 12:00:12 INFO - Current package versions: 12:00:12 INFO - argparse == 1.2.1 12:00:12 INFO - blessings == 1.6 12:00:12 INFO - blobuploader == 1.2.4 12:00:12 INFO - docopt == 0.6.1 12:00:12 INFO - functools32 == 3.2.3-2 12:00:12 INFO - jsonschema == 2.5.1 12:00:12 INFO - manifestparser == 1.1 12:00:12 INFO - mozInstall == 1.12 12:00:12 INFO - mozcrash == 0.17 12:00:12 INFO - mozdebug == 0.1 12:00:12 INFO - mozdevice == 0.48 12:00:12 INFO - mozfile == 1.2 12:00:12 INFO - mozhttpd == 0.7 12:00:12 INFO - mozinfo == 0.9 12:00:12 INFO - mozleak == 0.1 12:00:12 INFO - mozlog == 3.2 12:00:12 INFO - moznetwork == 0.27 12:00:12 INFO - mozprocess == 0.22 12:00:12 INFO - mozprofile == 0.28 12:00:12 INFO - mozrunner == 6.11 12:00:12 INFO - mozscreenshot == 0.1 12:00:12 INFO - mozsystemmonitor == 0.3 12:00:12 INFO - moztest == 0.7 12:00:12 INFO - mozversion == 1.4 12:00:12 INFO - psutil == 3.1.1 12:00:12 INFO - requests == 1.2.3 12:00:12 INFO - wsgiref == 0.1.2 12:00:12 INFO - Installing None into virtualenv /builds/slave/test/build/venv 12:00:12 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 12:00:12 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 12:00:12 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:00:12 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 12:00:12 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 12:00:12 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:00:12 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test/build/tests/talos/requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x213d030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x22a08a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x236c400>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x23fb570>, '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 0x23fc470>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x23fc900>, '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': 'c6927cf182745ad25b1d38b9000001fe-1467308939.208533-281882626', '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 12:00:12 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test/build/tests/talos/requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test/build/tests/talos 12:00:12 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 -r /builds/slave/test/build/tests/talos/requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 12:00:12 INFO - Using env: {'DISPLAY': ':0', 12:00:12 INFO - 'HOME': '/home/cltbld', 12:00:12 INFO - 'LANG': 'en_US.UTF-8', 12:00:12 INFO - 'LANGUAGE': 'en_US:en', 12:00:12 INFO - 'LOGNAME': 'cltbld', 12:00:12 INFO - 'MAIL': '/var/mail/cltbld', 12:00:12 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 12:00:12 INFO - 'MOZ_NO_REMOTE': '1', 12:00:12 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 12:00:12 INFO - 'NO_EM_RESTART': '1', 12:00:12 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 12:00:12 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 12:00:12 INFO - 'PWD': '/builds/slave/test', 12:00:12 INFO - 'SHELL': '/bin/bash', 12:00:12 INFO - 'SHLVL': '1', 12:00:12 INFO - 'TERM': 'linux', 12:00:12 INFO - 'TMOUT': '86400', 12:00:12 INFO - 'USER': 'cltbld', 12:00:12 INFO - 'XDG_SESSION_COOKIE': 'c6927cf182745ad25b1d38b9000001fe-1467308939.208533-281882626', 12:00:12 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 12:00:12 INFO - '_': '/tools/buildbot/bin/python'} 12:00:12 INFO - Ignoring indexes: https://pypi.python.org/simple/ 12:00:12 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)) 12:00:12 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)) 12:00:12 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)) 12:00:12 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)) 12:00:12 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)) 12:00:12 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)) 12:00:12 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)) 12:00:12 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)) 12:00:12 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)) 12:00:12 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)) 12:00:12 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)) 12:00:12 INFO - Cleaning up... 12:00:12 INFO - Return code: 0 12:00:12 INFO - Installing jsonschema into virtualenv /builds/slave/test/build/venv 12:00:12 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 12:00:12 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 12:00:12 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:00:12 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 12:00:12 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 12:00:12 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:00:12 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x213d030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x22a08a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x236c400>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x23fb570>, '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 0x23fc470>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x23fc900>, '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': 'c6927cf182745ad25b1d38b9000001fe-1467308939.208533-281882626', '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 12:00:12 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema'] in /builds/slave/test/build 12:00:12 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub jsonschema 12:00:12 INFO - Using env: {'DISPLAY': ':0', 12:00:12 INFO - 'HOME': '/home/cltbld', 12:00:12 INFO - 'LANG': 'en_US.UTF-8', 12:00:12 INFO - 'LANGUAGE': 'en_US:en', 12:00:12 INFO - 'LOGNAME': 'cltbld', 12:00:12 INFO - 'MAIL': '/var/mail/cltbld', 12:00:12 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 12:00:12 INFO - 'MOZ_NO_REMOTE': '1', 12:00:12 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 12:00:12 INFO - 'NO_EM_RESTART': '1', 12:00:12 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 12:00:12 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 12:00:12 INFO - 'PWD': '/builds/slave/test', 12:00:12 INFO - 'SHELL': '/bin/bash', 12:00:12 INFO - 'SHLVL': '1', 12:00:12 INFO - 'TERM': 'linux', 12:00:12 INFO - 'TMOUT': '86400', 12:00:12 INFO - 'USER': 'cltbld', 12:00:12 INFO - 'XDG_SESSION_COOKIE': 'c6927cf182745ad25b1d38b9000001fe-1467308939.208533-281882626', 12:00:12 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 12:00:12 INFO - '_': '/tools/buildbot/bin/python'} 12:00:12 INFO - Ignoring indexes: https://pypi.python.org/simple/ 12:00:12 INFO - Requirement already satisfied (use --upgrade to upgrade): jsonschema in ./venv/lib/python2.7/site-packages 12:00:12 INFO - Cleaning up... 12:00:12 INFO - Return code: 0 12:00:12 INFO - Running post-action listener: _resource_record_post_action 12:00:12 INFO - Running post-action listener: _start_resource_monitoring 12:00:12 INFO - Starting resource monitoring. 12:00:12 INFO - ##### 12:00:12 INFO - ##### Finished create-virtualenv step (success) 12:00:12 INFO - ##### 12:00:12 INFO - ##### 12:00:12 INFO - ##### Running install step. 12:00:12 INFO - ##### 12:00:12 INFO - Running pre-action listener: _resource_record_pre_action 12:00:12 INFO - Running main action method: install 12:00:12 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 12:00:12 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 12:00:12 INFO - Reading from file tmpfile_stdout 12:00:12 INFO - Detecting whether we're running mozinstall >=1.0... 12:00:12 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 12:00:12 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 12:00:12 INFO - Reading from file tmpfile_stdout 12:00:12 INFO - Output received: 12:00:12 INFO - Usage: mozinstall [options] installer 12:00:12 INFO - Options: 12:00:12 INFO - -h, --help show this help message and exit 12:00:12 INFO - -d DEST, --destination=DEST 12:00:12 INFO - Directory to install application into. [default: 12:00:12 INFO - "/builds/slave/test"] 12:00:12 INFO - --app=APP Application being installed. [default: firefox] 12:00:12 INFO - mkdir: /builds/slave/test/build/application 12:00:12 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '/builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2', '--destination', '/builds/slave/test/build/application'] 12:00:12 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall /builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 --destination /builds/slave/test/build/application 12:00:29 INFO - Reading from file tmpfile_stdout 12:00:29 INFO - Output received: 12:00:29 INFO - /builds/slave/test/build/application/firefox/firefox 12:00:29 INFO - Running post-action listener: _resource_record_post_action 12:00:29 INFO - ##### 12:00:29 INFO - ##### Finished install step (success) 12:00:29 INFO - ##### 12:00:29 INFO - ##### 12:00:29 INFO - ##### Running run-tests step. 12:00:29 INFO - ##### 12:00:29 INFO - Running pre-action listener: _resource_record_pre_action 12:00:29 INFO - Running main action method: run_tests 12:00:29 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 12:00:29 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 12:00:29 INFO - Python 2.7.3 12:00:29 INFO - Return code: 0 12:00:29 INFO - grabbing minidump binary from tooltool 12:00:29 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')]} 12:00:29 INFO - retry: Calling run_command with args: (['/tools/tooltool.py', '--url', 'https://api.pub.build.mozilla.org/tooltool/', '--authentication-file', '/builds/relengapi.tok', 'fetch', '-m', '/builds/slave/test/build/tests/config/tooltool-manifests/linux64/releng.manifest', '-o', '-c', '/builds/tooltool_cache'],), kwargs: {'output_timeout': 600, 'error_list': [{'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x23fb570>, '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 0x23fc470>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x23fc900>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 12:00:29 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 12:00:29 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 12:00:29 INFO - Calling ['/tools/tooltool.py', '--url', 'https://api.pub.build.mozilla.org/tooltool/', '--authentication-file', '/builds/relengapi.tok', 'fetch', '-m', '/builds/slave/test/build/tests/config/tooltool-manifests/linux64/releng.manifest', '-o', '-c', '/builds/tooltool_cache'] with output_timeout 600 12:00:29 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 12:00:29 INFO - Return code: 0 12:00:29 INFO - Chmoding /builds/slave/test/build/linux64-minidump_stackwalk to 0755 12:00:29 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 12:00:29 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 12:00:29 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/linux64-minidump_stackwalk 12:00:29 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 12:00:29 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Autoland-Non-PGO', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/UOlgP3uLQCa0cXZY2usHCA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-004', '--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 12:00:29 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/tests/talos/talos/run_tests.py --branchName Autoland-Non-PGO --suite dromaeojs-e10s --executablePath /builds/slave/test/build/application/firefox/firefox --symbolsPath https://queue.taskcluster.net/v1/task/UOlgP3uLQCa0cXZY2usHCA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.crashreporter-symbols.zip --title talos-linux64-ix-004 --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 12:00:29 INFO - Using env: {'DISPLAY': ':0', 12:00:29 INFO - 'HOME': '/home/cltbld', 12:00:29 INFO - 'LANG': 'en_US.UTF-8', 12:00:29 INFO - 'LANGUAGE': 'en_US:en', 12:00:29 INFO - 'LOGNAME': 'cltbld', 12:00:29 INFO - 'MAIL': '/var/mail/cltbld', 12:00:29 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 12:00:29 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/linux64-minidump_stackwalk', 12:00:29 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 12:00:29 INFO - 'MOZ_NO_REMOTE': '1', 12:00:29 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 12:00:29 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 12:00:29 INFO - 'NO_EM_RESTART': '1', 12:00:29 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 12:00:29 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 12:00:29 INFO - 'PWD': '/builds/slave/test', 12:00:29 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 12:00:29 INFO - 'SHELL': '/bin/bash', 12:00:29 INFO - 'SHLVL': '1', 12:00:29 INFO - 'TERM': 'linux', 12:00:29 INFO - 'TMOUT': '86400', 12:00:29 INFO - 'USER': 'cltbld', 12:00:29 INFO - 'XDG_SESSION_COOKIE': 'c6927cf182745ad25b1d38b9000001fe-1467308939.208533-281882626', 12:00:29 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 12:00:29 INFO - '_': '/tools/buildbot/bin/python'} 12:00:29 INFO - Calling ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Autoland-Non-PGO', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/UOlgP3uLQCa0cXZY2usHCA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-004', '--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 12:00:29 INFO - mozversion application_buildid: 20160630110129 12:00:29 INFO - mozversion application_changeset: 2f3a0b0aab552654bd8bc2bbfe84c8ec24023ae1 12:00:29 INFO - mozversion application_display_name: Nightly 12:00:29 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 12:00:29 INFO - mozversion application_name: Firefox 12:00:29 INFO - mozversion application_remotingname: firefox 12:00:29 INFO - mozversion application_repository: https://hg.mozilla.org/integration/autoland 12:00:29 INFO - mozversion application_vendor: Mozilla 12:00:29 INFO - mozversion application_version: 50.0a1 12:00:29 INFO - mozversion platform_buildid: 20160630110129 12:00:29 INFO - mozversion platform_changeset: 2f3a0b0aab552654bd8bc2bbfe84c8ec24023ae1 12:00:29 INFO - mozversion platform_repository: https://hg.mozilla.org/integration/autoland 12:00:29 INFO - mozversion platform_version: 50.0a1 12:00:29 INFO - using testdate: 1467313229 12:00:29 INFO - actual date: 1467313229 12:00:29 INFO - starting webserver on 'localhost:54659' 12:00:29 INFO - SUITE-START | Running 2 tests 12:00:29 INFO - TEST-START | dromaeo_css 12:00:29 INFO - operating with platform_type : linux_ 12:00:29 INFO - Initialising browser for dromaeo_css test... 12:00:29 INFO - TEST-INFO | started process 26394 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpf2o93Q/profile http://localhost:54659/getInfo.html) 12:00:34 INFO - PROCESS | 26394 | __metrics Screen width/height:1600/1200 12:00:34 INFO - PROCESS | 26394 | colorDepth:24 12:00:34 INFO - PROCESS | 26394 | Browser inner width/height: 1024/697 12:00:34 INFO - PROCESS | 26394 | __metrics 12:00:35 ERROR - PROCESS | 26394 | JavaScript error: chrome://browser/content/tabbrowser.xml, line 2968: TypeError: this.tabs is undefined 12:00:36 INFO - TEST-INFO | 26394: exit 0 12:00:36 INFO - Browser initialized. 12:00:36 INFO - Running cycle 1/1 for dromaeo_css test... 12:00:36 INFO - TEST-INFO | started process 26515 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpf2o93Q/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 12:00:48 INFO - PROCESS | 26515 | RSS: Main: 169472000 12:00:48 INFO - PROCESS | 26515 | 12:01:37 INFO - PROCESS | 26515 | 1467313297698 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] 12:03:49 INFO - PROCESS | 26515 | Cycle 1(1): loaded http://localhost:54659/tests/dromaeo/cssquery-dojo.html (next: http://localhost:54659/tests/dromaeo/cssquery-ext.html) 12:03:50 INFO - PROCESS | 26515 | RSS: Main: 170450944 12:03:50 INFO - PROCESS | 26515 | 12:06:52 INFO - PROCESS | 26515 | Cycle 1(1): loaded http://localhost:54659/tests/dromaeo/cssquery-ext.html (next: http://localhost:54659/tests/dromaeo/cssquery-jquery.html) 12:06:53 INFO - PROCESS | 26515 | RSS: Main: 169443328 12:06:53 INFO - PROCESS | 26515 | 12:09:55 INFO - PROCESS | 26515 | Cycle 1(1): loaded http://localhost:54659/tests/dromaeo/cssquery-jquery.html (next: http://localhost:54659/tests/dromaeo/cssquery-mootools.html) 12:09:56 INFO - PROCESS | 26515 | RSS: Main: 173191168 12:09:56 INFO - PROCESS | 26515 | 12:12:57 INFO - PROCESS | 26515 | Cycle 1(1): loaded http://localhost:54659/tests/dromaeo/cssquery-mootools.html (next: http://localhost:54659/tests/dromaeo/cssquery-prototype.html) 12:12:58 INFO - PROCESS | 26515 | RSS: Main: 168448000 12:12:58 INFO - PROCESS | 26515 | 12:16:01 INFO - PROCESS | 26515 | Cycle 1(1): loaded http://localhost:54659/tests/dromaeo/cssquery-prototype.html (next: http://localhost:54659/tests/dromaeo/cssquery-yui.html) 12:16:01 INFO - PROCESS | 26515 | RSS: Main: 170434560 12:16:01 INFO - PROCESS | 26515 | 12:19:04 INFO - PROCESS | 26515 | Cycle 1(1): loaded http://localhost:54659/tests/dromaeo/cssquery-yui.html (next: http://localhost:54659/tests/dromaeo/cssquery-dojo.html) 12:19:04 INFO - PROCESS | 26515 | RSS: Main: 170864640 12:19:04 INFO - PROCESS | 26515 | 12:19:04 INFO - PROCESS | 26515 | __start_tp_report 12:19:04 INFO - PROCESS | 26515 | _x_x_mozilla_page_load 12:19:04 INFO - PROCESS | 26515 | _x_x_mozilla_page_load_details 12:19:04 INFO - PROCESS | 26515 | |i|pagename|runs| 12:19:04 INFO - PROCESS | 26515 | |0;dojo.html;2649.496595646827;2666.9866650666745;2669.452762183752;2693.0574298995366;2693.973060269398;4686.859394218171;4724.787384567694;4741.099191153683;4797.352357431746;4828.927566086511;4666.603338716213;4806.327114204014;4883.389576302962;4884.609231261499;4903.779329930153;4373.387725718402;4392.9560704393025;4519.751413672247;4524.049949510607;4526.253168227255;4202.159568086379;4487.685861989662;4498.662600304974;4577.908441831161;4583.587477127058;4355.716878402894;4384.145091707119;4424.3142312941545;4454.131444368317;4462.040661257829;4385.057212699253;4391.5827996340295;4445.599896009375;4445.9110817783785;4470.642348612103;4415.359772832921;4428.977855110704;4437.4896886858105;4462.754548499831;4480.126375356806;4735.73953432561;4782.0914026334885;4787.784549695272;4801.447833499157;4808.543188397097;5090.949090509122;5093.337866077386;5097.9490205097845;5110.616703747234;5170.715610641413;5140.460251673558;5144.6141539384325;5162.5095615916425;5166.741662916839;5166.767495462713;4816.54242846929;4820.758962051918;4822.445418776885;4828.420589529279;4864.489228630978;5322.042032434121;5326.6005049621435;5329.1206950852675;5329.467053294639;5336.092864213016;5029.698218106925;5030.37120359955;5041.873953151127;5070.670406423571;5089.6691715038405;4957.355543779286;5137.6660517066275;5146.742662866842;5158.690478571298;5168.8449346519665;5116.769745361467;5124.590032797441;5166.6641668292195;5182.326297581366;5185.196294574347;4899.167141585939;5105.361829771278;5143.948560514347;5167;5207.7916883325;4364.301711726109;4364.956350436455;4369.235383807821;4378.6278166356215;4409.11817636474;3731.1604888900324;3829.463875057494;3846.4999550058874;3847.153626202231;3879.049632839916;4541.159885421208;4547.636189104864;4567.36056952027;4598.448186217675;4602.953970460252;5253.632245742838;5270.183121616155;5303.602229832778;5306.548943339782;5353.063213937546;4470.619997300201;4542.318652202196;4581.725096494221;4605.884852878705;4630.745309008037;4669.883252918704;4694.413198350207;4708.364370809965;4713.858584242478;4756.7145971241835;4904.5340692634145;4920.237363208708;4926.531979461945;4929.13740095489;4957.182064959241;5061.291419201389;5159.355080614923;5193.922091168711;5244.396894357198;5307.41618421981;4867.513248675245;4900.852974410774;4905.730184839726;4943.209086546135;4946.282788995503;5108.106081435808;5116.539511443988;5118.129917913889;5124.282600435868;5132.8460146195675;5105.18317069282;5138.3063286457345;5155.046316431472;5186.58507319406;5233.842984710464;4808.903821923612;4870.05034018363;5026.74866256693;5058.241263810458;5092.41437234708;5086;5096.05722941257;5097.7706003229205;5129.769160387867;5172.250023746611;4755.928661070017;4905.533974272438;4978.8755281118265;5028.220625803006;5047.041062198171;5047.899042019212;5097.2608971698155;5105.055564720538;5107.157319042316;5127.87180320495;4981.252812078217;4992.700437973734;5005.174146265826;5016.072026675077;5031.823886163967 12:19:04 INFO - PROCESS | 26515 | |1;ext.html;514.9716765577891;563.4140493886358;565.6888711208836;576.0638961687258;581.816727730765;40320;41918.16163676725;41955.58044419555;42026.57973420265;45986.31020534686;43448.13103737924;43621.345679814825;43882.56117438833;44031.779841100826;44117.33823992643;7854.960725196366;7987.121416644164;8012.5593092379895;8014.919850801476;8032.638531266078;7778.53328800271;7853.253940875607;7889.447738658297;7890.447668663196;7896.80257993549;7818.609069546528;7885.093214280345;7915.960420197891;7928;7936.246056624612;7834.138244793096;7860;7932.5240485570475;7934.246246606564;7935.563544005077;7869.685212591489;7909.446338756289;7971.960140199262;7979.56112413817;7991.840163196762;40456.59543404558;40838.38742418866;40984.590154098376;41010.38484422736;41061.58938410637;3088.9536656950163;3121.1884909923356;3131.4676504994204;3180.522921561784;3198.952015719766;29984.250393740112;30015.69984300151;30038.69961300381;30412;31077.223069423446;3400.4219282721997;3423.1955490459973;3429.9828500857584;3433.639467855889;3471.6528347165336;260313;261831;261944.6902765493;262001;262381;32574.511382329285;55255.44744552583;55634.44365556374;55852.16221756677;56030.719846400505;33237.667623323454;35355.292894141974;35472;35526;35548.46677299843;12924.483020679256;13119.540816071583;13119.868801311864;13125.737485250433;13151.802722959163;10635.94682026585;10650.680479585624;10689.518971646294;10701.946490267655;10712.571497140027;7991.800204994805;8037.879431808527;8073.273405393543;8108.310793582612;8136.593170341459;3133.498640217554;3170.128214740919;3173.809571425722;3178.491441369416;3190.9361812763614;882.6778225947611;889.5552223887927;919.5402298850574;1022.2077889635443;1026.5370754613914;29215;29291.121266362043;29460.705392946224;29692;29829.10512684623;966.7293157915794;980.4460479828874;1006.8942761009988;1022;1036.6319956415514;14714.484993025408;15105.3202605883;15163.393464261306;15269.465568705042;15429.228538573027;405612;409240;409565;410575;411511;52208.216876746876;52808.47191528112;52842.73578632082;52947.47052529502;53049;1158.6697791129488;1178.1752773058893;1215.8419405477232;1219.6828824505692;1230.7907655698552;26988;28281.292967675974;28345;28707.569386458803;28768.568471472525;43851;44387;44423.77788111168;44670;44764.32853507265;331714;333963;334448;335618;339082;26241.21276361712;26457.867710661325;26912;26934.730652693223;27100.72899270982;44479.77760111179;44601.54691491999;44817;45289;45680.54319456763;37660.811695941346;38157;39012.2197556053;39160.2167956645;39409.211815764094;36924;38397.6160238394;38501;38738.4189237156;39234.803825980685;36707;37668.62331376651;37808.24383512369;37977.4303385455;38114.237715244984;32440;33615.495767563014;34038;34258.314833703684;34678.82660586681;26469.33826654349;26557.336066597716;26577.46845063049;26657.866710666323;27014.459710806066 12:19:04 INFO - PROCESS | 26515 | |2;jquery.html;370.99072523186925;371.54856848928546;373.60771190250233;382.7703377973215;388.8813911756913;16755;17107.572310692238;17482.300707971666;17517.299308027694;17541.82458175418;15831.366745330173;15930.681386372265;16774.161291935387;16806.747898781527;16814.32742690291;4745.786439610209;4851.63612729045;4868.318435419044;4880.341153944225;4886.071646387175;3407.250404910928;5928.288605367362;6232.034034724625;6243.968780156116;6367.4906007519285;5428.972855135718;6077.63534187948;6173.444390004899;6284.183056202687;6299.590526615778;5247;5380.085385484477;5386.407495175527;5392.946070539284;5402.594805389592;4635.745034023127;4931.43288521821;5228.2680424740565;5241.135212689902;5242.842714718565;12100;12280.570180043656;12302.630921072292;12334.629961101182;17143.485695429157;2005.9097340619708;2033.8169564739244;2037.022229329915;2074.294739788479;2371.3004663624274;9023.639054437881;9033.638654453815;9123.908760912438;9246.075392460767;9328.766780830465;1683.7474378843149;1719.2177559210654;1734.2889415339775;1761.6652835961254;1794.3181590995468;67137;73054;73717.26282737158;74497.62751186264;74766.25233747647;9570.186534144537;9737.756556086013;9885.851712224323;9972.551235194434;10063.446510441996;13268.40292186854;13334.733305333839;13361.73276534464;13385.129966552144;13396.995225357941;7002.579845209304;7098.219195888448;7104.964475177591;7183.5330703504105;7299;6638.535302528777;6695.832604184837;6794.898076528856;6805.3875151236625;7021.403180729593;3797.715171362159;4175.707700460938;4250.171216612793;4283.721558098714;4373.978130109329;1685.9241334139747;1816.5013863562613;1818.9818101819078;1822.2801993212606;1827.6801559726994;783.3693876429415;842.9578521074044;846.1622993236651;862.2369203255039;870.9303255739526;16566.337346506003;16979.91510042442;17109.657806843792;17694.82305176932;17979.550511237325;858.5964596639569;867.7179916527153;880.2605811118563;889.6708217959267;892.4238072126856;9970.351927124859;9973.451460169761;10017.148542373834;10041.849372259421;10056.798864022825;345489;346103;399446;413032;415644;83934.58032709797;84617;85746.57126714327;86789;86844;909.5725009245645;916.6333466613409;927.9211267042377;931.5621657820814;959.0170075672492;12736.299503527025;15465.917385783338;15895.125768082866;15938.804589656054;16282.837171628606;35131.64868351284;35786;36892.81553592215;40176.39735403913;40190.19619607533;49344.259836101766;50086.749566251936;54327.45672543224;54717;55317.723411382685;7668.846623067619;7947.960260198894;7961.243681850215;8012.31895288907;8038.799030024296;8670.609822558126;10488;11536.711582210512;11747.118966077749;11879.10906681985;5259.8422047338645;10214.08073273409;10259.281850270709;10577.471126443494;10752.247342686249;10254.948725256625;10407.791844163226;10677.839832402366;10688.091512221548;10810.67567972962;10255.58977640886;10551;10591.152707783513;10623.946880265548;10682.679519614425;6625.668716564249;6946.097007389007;7730.420218483524;7740.729074482366;7793.181715919747;10013.299069065095;10409.68770936873;10419.63531276432;10728.946355268174;10860.456977151269 12:19:04 INFO - PROCESS | 26515 | |3;mootools.html;1383.7232553489298;1409.6757745718485;1527.7631967045104;1676.5138109948116;1730.9999999999993;7148.142222933256;7861.489003214794;7912.406569507281;8390.580470976449;8425.199606037431;8003.559804210766;8228.629711662974;8258.710945116922;8334.249917507423;8339.29116025137;2214.1143542582936;2214.2914267434426;2234.821214302852;2238.9812635250923;2240.7535171131162;2170.435686721448;2179.455136215946;2226.7995880370763;2240.6639004149347;2242.8654280743126;2238.440389902524;2247.6291411917014;2250.6624006399006;2255.2670382125793;2273.920412785553;2146.0879126371306;2152.074607918594;2161.6541353383464;2166.674998750192;2174.2607513445346;2144.4746037220825;2147.452399638098;2161.1679503391306;2163.8809865457392;2179.4333473296897;8251.257386835154;8321.292690121347;8374.371922105805;8384.832303353898;8387;4512.458504979423;4524.864254072383;4550.226461501553;4552.749598772066;4555.635549156093;2871.3826527296524;2930.7508861746564;2977.7766667500023;2983.6867128951367;3012.0813151988636;930.3255140023497;940.9247260219166;954.4988880837616;962.6486332488661;966.9661561845302;11406.828897566544;11470.139739519485;11480.712982175512;11488.712782180346;11509.539618415254;4073.5315438724924;4168.791560421967;4337.457817772778;4351.390805287262;4361.411209486742;9629.133377995873;9637.614495420245;9639.807203855884;9689.612415503301;9707.126358627616;4507.4365704286965;4577.496475387705;4585.885352866138;4618.330342100377;4619.1685496610935;3701.1857391373856;4092.508898932147;4160.313548264563;4174.5616710245595;4230.048239146229;3720.813959302024;3723;3726.4037753959237;3822.7132965027736;3852.556955950102;1168.5325869652206;1193.570314686712;1193.886580774825;1194.1640851404052;1204.3917821500086;664.9135612370458;726.989095163573;750.8761054425959;761.3034073822502;776.0183368039435;4925.532074452921;5059.873503162376;5109.897802043938;5143.871403214875;5196.272521846944;382.2622338885977;386.9883903482844;387.60077120565296;389.96880249580533;398.8384704194806;3507.649235076472;3589.6230895756094;3652.342578335872;3672.13704779382;3697.0942119180972;9981;10128.898711012944;10265.435401052864;10409.9479502602;10472.73818154537;10220.080192782685;10281.897181028095;10324.741881452874;10342.896571034193;10353.844692329621;7546.094468663796;7612.086549614081;7653.387728981556;7719.34385577221;7763.301302882767;5210.374755029421;5263.394709608444;5311.681299122065;5325.680459172462;5335.146376579729;9163.541822908961;9482.38364506305;9584.856227156737;9598.42409455407;9600.567974441026;9403.858942115738;9569.043095690375;9715.951420242853;9767.755806104904;9788.804223915624;6926.445884329342;6992.405645520188;7024.964875175591;7029.05107810439;7031.859362812817;7681.270279323456;7705.768826935201;7763.961180194063;7770.45606807518;7820.726274580363;6976.441884649317;7180.712771489082;7186.389156921511;7239.203687594255;7267.672954717156;7137.2149063604;7162.7069941786685;7173.892391614026;7173.928260717535;7223;6009.2188015557695;6049.334573197033;6084.300305464928;6094.39056094387;6118.816435506942;4364.62900653448;4375.081232941118;4397.670174736843;4456.5766252205985;4486.2597671383855;4561.657875659273;4604.516525764747;4642.791074401727;4660.953390466052;4673.112108699336 12:19:04 INFO - PROCESS | 26515 | |4;prototype.html;281.76754177803303;290.7426927169455;293.48053944518216;293.90448104366084;295.71906688645794;4939.28380384844;5036.7481625918645;5152.742362881855;5216.5826733861295;5217.165253559431;5033.395992480908;5067.189249720045;5073.619478539115;5089.353536161194;5103.8468845934685;4037.253108174997;4040.5757395473493;4042.5957404259634;4052.4731784868072;4069.9796501017454;3985.3623420252766;4028.858989935353;4078.4086307485395;4088.652464540503;4091.6317531422164;4005.9799701001452;4011.653182888014;4014.919701605966;4025.2553277643583;4032.8386864525382;4023.5976402359825;4028.738132021424;4032.475778148851;4041.6968727345566;4045.7977101144825;3558.839852206657;3581.5881173665102;3588.6770190682964;3602.0994751312173;3620.981895090508;4857.708537487762;4998.775055122528;5002.549770520671;5002.74986250686;5081.136206844845;4587.7706114694465;4612.285095810154;4627.722336659811;4631.698939568951;4654.720716757005;5353.38436079848;5354.812581559627;5401.297831281948;5422.8373148805595;5427.810026649048;3461.394256005189;3661.3043521730788;3672.9632703672887;3680.926381472382;3879.515060617423;5534.418886016951;5569.832905012856;5598.412166722517;5604.859878503029;5641.2384328116;3712.7957962311793;3717.9442308365396;3725.832337544817;3735.6824669902817;3747.3254814133716;3613.674769270778;3774.9433758493647;3782.8108594570713;3796;3802.961970380316;4381.868543943623;4428.800703968329;4439.912221505687;4445.666300109954;4459.130469558405;5322.840314790563;5326.627136100436;5378.462153784591;5378.91931621026;5379.784808607612;1230.2249582762981;1291.593148158346;1312.9015323850558;1314.9013823963242;1323.8940884729197;803.493798906685;827.185222555782;836.824266903957;838.5681374092347;841.886345343383;4581.106684196549;4595.816167353335;4602.746848923274;4674.345591617176;4707.03505781314;5448.482394172547;5450.937067271844;5469.042917489423;5469.206964990054;5498.505134537831;4558.566936141061;4635.536446355338;4666.906661866744;4672.836450724209;4698.906021879611;2549.3244290263096;2579.7291284414864;2584.3539115221197;2600.765931066213;2633.6305121336795;4589.908201835945;4593.26507758757;4605.286180642006;4627.814887404534;4670.6497012724185;4656.278276867091;4892.975535122301;4927.28554359623;4927.507249275044;4966.354373931365;4538.228501154812;4562.452505699337;4562.520935301812;4585.220512512814;4631.258998560214;4813.302071199586;4862.0341591629785;4863.927041094315;4873.853784386474;4902.7058376497525;4563.703359281636;4767.737774422301;4769.73766442849;4812.411904071718;4829.396325459317;4496.348029535764;4539.892620801598;4567.314902764612;4584.518625544403;4599.264117741145;3427.5715535558056;3428.657134286651;3431.879884204041;3435.1068722131927;3445.87939422119;4839.661223714447;4869.926951095666;4877.292792545132;4912.484189160086;5337.786488540571;5077.1876499759865;5347.117725575392;5349.518543331119;5356.946430535645;5368.409474957673;5329.440408757025;5363.222332761806;5374.355077390738;5389.8113566025;5397.379301380392;5155.561777248976;5253.737313134252;5259.738961843682;5288.629795914249;5305.65513241638;5355.60754203902;5392.892142157057;5398.568114550905;5410.3778065522965;5419.972900135474;5201.349831271091;5232.424433312409;5272.261883336413;5308.761105750174;5314.734263286898 12:19:04 INFO - PROCESS | 26515 | |5;yui.html;604.5496105401477;639.8240483866936;644.7743289848556;649.2987573420706;735.1362149474367;12897.484100635975;13788.379522921468;14076.296185190751;14817.333220005099;14887.925560372183;14720.26398680067;14819.703605927874;14876.47932322369;14916.850831491682;14988;634.3878157577936;777.4091690315373;780.2821404308036;805.4844899264447;806.7176488229131;780.6292011294646;780.9531428114303;782.6008735544856;785.1755656560617;786.3159051625095;830.0869044051556;830.8961379827522;832.0930186097153;833.3541505333385;833.6665333866441;815.3925325632412;825.3397282174236;826.1944604011101;826.5454000299811;828.6892415344277;606.884691908536;610.3012051201349;610.7709608896664;610.9511239100862;611.9020956646915;14441.133531988009;14525.854741452556;14556.563303100924;14562.781558276634;14602;13383.263920484369;13527.864721352758;13719.612721441179;13814.585562433143;13820.447182112703;10043.849342259871;10206.081452669221;10232.641857535025;10272.435016074112;10303.639372621923;3006.2484378905274;3058.3118798270434;3075.784695071346;3098.1325228935934;3106.285554322496;67189.32810671879;67953.32046679569;68923.65538172328;70012;70446.64776676084;9730.464824434583;9976.551055202533;10182.134518566005;10194.184465242763;10213.131883789812;15934.362625495081;16323;16325.510234692978;16379.754303685455;16492;6654.733810647616;6737.258901520829;6833.282505336968;6887.931120688829;7071.151461824614;3850.0567360996174;3880.3015457217407;3893.5717071122153;3954.149857780591;4031.677465802729;2831.7734581233863;2939.3092623233524;2947.7494412974706;2966.8961586344376;2972.4203780263074;518.4582111693289;522.3261992030315;525.1545012529824;526.2474661234395;534.981275655358;538.733327003136;552.1827695011325;573.7332140554662;580.4833698008775;586.8591538030927;7980.760577182694;8063.475874068166;8148.877766833502;8176.7955801105445;8178.836423271501;574.6408494690818;579.7883772423036;582.022202699469;602.9879402411927;609.2141137932018;3861.4860476966387;3903.6291552302487;3964.5440774310746;3972.900677483086;4017.658499027557;74266;97769;99914;101417.49291253496;101608;87510;88214.55892720495;88941.55529222313;90086;92626.53686731523;74071;75487.24512754912;78042.6097869507;79813.60093199497;80926;7289.671964761705;7348.926510735038;7647.120581133018;7684.001079859582;7709.306162445182;45953.54046459626;47138.76430617825;47920.28119578279;48342.75828620975;48774.268385973526;62955.6852215736;67166.328336716;67212;67305;67336.6633166831;9694.6122155113;9706.75733106678;9708.5145742714;9775.608975641178;9802.705918822447;11066.502007409525;11124.888751112385;11856.940715296714;11926.403679816149;12347.62957111288;11178.552857885594;11578.94210528942;12184.451699673358;12226.816597751218;12227;10699.743404301742;11066.114710822954;11725.88274117248;12072.517099315928;12164.695882603006;10513.632022879163;10617.309874858109;10921.071708904514;11248.88751112511;11748.70628234301;9815.2147828175;10285.794284114127;10416.583336666448;10553.102986245947;10589.682309530726;9982.60069597208;10150.644727434505;10224.233182511192;10263.640772572924;10672.46637668129 12:19:04 INFO - PROCESS | 26515 | __end_tp_report 12:19:04 INFO - PROCESS | 26515 | __start_cc_report 12:19:04 INFO - PROCESS | 26515 | _x_x_mozilla_cycle_collect,382 12:19:04 INFO - PROCESS | 26515 | __end_cc_report 12:19:04 INFO - PROCESS | 26515 | __startTimestamp1467314344791__endTimestamp 12:19:04 INFO - PROCESS | 26515 | 12:19:04 INFO - PROCESS | 26515 | ------- Summary: start ------- 12:19:04 INFO - PROCESS | 26515 | Number of tests: 6 12:19:04 INFO - PROCESS | 26515 | 12:19:04 INFO - PROCESS | 26515 | [#0] dojo.html Cycles:165 Average:4785.48 Median:4905.53 stddev:503.72 (10.3%) stddev-sans-first:476.58 12:19:04 INFO - PROCESS | 26515 | Values: 2649.5 2667.0 2669.5 2693.1 2694.0 4686.9 4724.8 4741.1 4797.4 4828.9 4666.6 4806.3 4883.4 4884.6 4903.8 4373.4 4393.0 4519.8 4524.0 4526.3 4202.2 4487.7 4498.7 4577.9 4583.6 4355.7 4384.1 4424.3 4454.1 4462.0 4385.1 4391.6 4445.6 4445.9 4470.6 4415.4 4429.0 4437.5 4462.8 4480.1 4735.7 4782.1 4787.8 4801.4 4808.5 5090.9 5093.3 5097.9 5110.6 5170.7 5140.5 5144.6 5162.5 5166.7 5166.8 4816.5 4820.8 4822.4 4828.4 4864.5 5322.0 5326.6 5329.1 5329.5 5336.1 5029.7 5030.4 5041.9 5070.7 5089.7 4957.4 5137.7 5146.7 5158.7 5168.8 5116.8 5124.6 5166.7 5182.3 5185.2 4899.2 5105.4 5143.9 5167.0 5207.8 4364.3 4365.0 4369.2 4378.6 4409.1 3731.2 3829.5 3846.5 3847.2 3879.0 4541.2 4547.6 4567.4 4598.4 4603.0 5253.6 5270.2 5303.6 5306.5 5353.1 4470.6 4542.3 4581.7 4605.9 4630.7 4669.9 4694.4 4708.4 4713.9 4756.7 4904.5 4920.2 4926.5 4929.1 4957.2 5061.3 5159.4 5193.9 5244.4 5307.4 4867.5 4900.9 4905.7 4943.2 4946.3 5108.1 5116.5 5118.1 5124.3 5132.8 5105.2 5138.3 5155.0 5186.6 5233.8 4808.9 4870.1 5026.7 5058.2 5092.4 5086.0 5096.1 5097.8 5129.8 5172.3 4755.9 4905.5 4978.9 5028.2 5047.0 5047.9 5097.3 5105.1 5107.2 5127.9 4981.3 4992.7 5005.2 5016.1 5031.8 12:19:04 INFO - PROCESS | 26515 | 12:19:04 INFO - PROCESS | 26515 | [#1] ext.html Cycles:180 Average:48646.42 Median:37892.84 stddev:89940.48 (237.4%) stddev-sans-first:90120.19 12:19:04 INFO - PROCESS | 26515 | Values: 515.0 563.4 565.7 576.1 581.8 40320.0 41918.2 41955.6 42026.6 45986.3 43448.1 43621.3 43882.6 44031.8 44117.3 7855.0 7987.1 8012.6 8014.9 8032.6 7778.5 7853.3 7889.4 7890.4 7896.8 7818.6 7885.1 7916.0 7928.0 7936.2 7834.1 7860.0 7932.5 7934.2 7935.6 7869.7 7909.4 7972.0 7979.6 7991.8 40456.6 40838.4 40984.6 41010.4 41061.6 3089.0 3121.2 3131.5 3180.5 3199.0 29984.3 30015.7 30038.7 30412.0 31077.2 3400.4 3423.2 3430.0 3433.6 3471.7 260313.0 261831.0 261944.7 262001.0 262381.0 32574.5 55255.4 55634.4 55852.2 56030.7 33237.7 35355.3 35472.0 35526.0 35548.5 12924.5 13119.5 13119.9 13125.7 13151.8 10635.9 10650.7 10689.5 10701.9 10712.6 7991.8 8037.9 8073.3 8108.3 8136.6 3133.5 3170.1 3173.8 3178.5 3190.9 882.7 889.6 919.5 1022.2 1026.5 29215.0 29291.1 29460.7 29692.0 29829.1 966.7 980.4 1006.9 1022.0 1036.6 14714.5 15105.3 15163.4 15269.5 15429.2 405612.0 409240.0 409565.0 410575.0 411511.0 52208.2 52808.5 52842.7 52947.5 53049.0 1158.7 1178.2 1215.8 1219.7 1230.8 26988.0 28281.3 28345.0 28707.6 28768.6 43851.0 44387.0 44423.8 44670.0 44764.3 331714.0 333963.0 334448.0 335618.0 339082.0 26241.2 26457.9 26912.0 26934.7 27100.7 44479.8 44601.5 44817.0 45289.0 45680.5 37660.8 38157.0 39012.2 39160.2 39409.2 36924.0 38397.6 38501.0 38738.4 39234.8 36707.0 37668.6 37808.2 37977.4 38114.2 32440.0 33615.5 34038.0 34258.3 34678.8 26469.3 26557.3 26577.5 26657.9 27014.5 12:19:04 INFO - PROCESS | 26515 | 12:19:04 INFO - PROCESS | 26515 | [#2] jquery.html Cycles:180 Average:24313.22 Median:4266.95 stddev:63998.67 (1499.9%) stddev-sans-first:64152.95 12:19:04 INFO - PROCESS | 26515 | Values: 371.0 371.5 373.6 382.8 388.9 16755.0 17107.6 17482.3 17517.3 17541.8 15831.4 15930.7 16774.2 16806.7 16814.3 4745.8 4851.6 4868.3 4880.3 4886.1 3407.3 5928.3 6232.0 6244.0 6367.5 5429.0 6077.6 6173.4 6284.2 6299.6 5247.0 5380.1 5386.4 5392.9 5402.6 4635.7 4931.4 5228.3 5241.1 5242.8 12100.0 12280.6 12302.6 12334.6 17143.5 2005.9 2033.8 2037.0 2074.3 2371.3 9023.6 9033.6 9123.9 9246.1 9328.8 1683.7 1719.2 1734.3 1761.7 1794.3 67137.0 73054.0 73717.3 74497.6 74766.3 9570.2 9737.8 9885.9 9972.6 10063.4 13268.4 13334.7 13361.7 13385.1 13397.0 7002.6 7098.2 7105.0 7183.5 7299.0 6638.5 6695.8 6794.9 6805.4 7021.4 3797.7 4175.7 4250.2 4283.7 4374.0 1685.9 1816.5 1819.0 1822.3 1827.7 783.4 843.0 846.2 862.2 870.9 16566.3 16979.9 17109.7 17694.8 17979.6 858.6 867.7 880.3 889.7 892.4 9970.4 9973.5 10017.1 10041.8 10056.8 345489.0 346103.0 399446.0 413032.0 415644.0 83934.6 84617.0 85746.6 86789.0 86844.0 909.6 916.6 927.9 931.6 959.0 12736.3 15465.9 15895.1 15938.8 16282.8 35131.6 35786.0 36892.8 40176.4 40190.2 49344.3 50086.7 54327.5 54717.0 55317.7 7668.8 7948.0 7961.2 8012.3 8038.8 8670.6 10488.0 11536.7 11747.1 11879.1 5259.8 10214.1 10259.3 10577.5 10752.2 10254.9 10407.8 10677.8 10688.1 10810.7 10255.6 10551.0 10591.2 10623.9 10682.7 6625.7 6946.1 7730.4 7740.7 7793.2 10013.3 10409.7 10419.6 10728.9 10860.5 12:19:04 INFO - PROCESS | 26515 | 12:19:04 INFO - PROCESS | 26515 | [#3] mootools.html Cycles:180 Average:5311.59 Median:4569.58 stddev:3121.83 (68.3%) stddev-sans-first:3116.63 12:19:04 INFO - PROCESS | 26515 | Values: 1383.7 1409.7 1527.8 1676.5 1731.0 7148.1 7861.5 7912.4 8390.6 8425.2 8003.6 8228.6 8258.7 8334.2 8339.3 2214.1 2214.3 2234.8 2239.0 2240.8 2170.4 2179.5 2226.8 2240.7 2242.9 2238.4 2247.6 2250.7 2255.3 2273.9 2146.1 2152.1 2161.7 2166.7 2174.3 2144.5 2147.5 2161.2 2163.9 2179.4 8251.3 8321.3 8374.4 8384.8 8387.0 4512.5 4524.9 4550.2 4552.7 4555.6 2871.4 2930.8 2977.8 2983.7 3012.1 930.3 940.9 954.5 962.6 967.0 11406.8 11470.1 11480.7 11488.7 11509.5 4073.5 4168.8 4337.5 4351.4 4361.4 9629.1 9637.6 9639.8 9689.6 9707.1 4507.4 4577.5 4585.9 4618.3 4619.2 3701.2 4092.5 4160.3 4174.6 4230.0 3720.8 3723.0 3726.4 3822.7 3852.6 1168.5 1193.6 1193.9 1194.2 1204.4 664.9 727.0 750.9 761.3 776.0 4925.5 5059.9 5109.9 5143.9 5196.3 382.3 387.0 387.6 390.0 398.8 3507.6 3589.6 3652.3 3672.1 3697.1 9981.0 10128.9 10265.4 10409.9 10472.7 10220.1 10281.9 10324.7 10342.9 10353.8 7546.1 7612.1 7653.4 7719.3 7763.3 5210.4 5263.4 5311.7 5325.7 5335.1 9163.5 9482.4 9584.9 9598.4 9600.6 9403.9 9569.0 9716.0 9767.8 9788.8 6926.4 6992.4 7025.0 7029.1 7031.9 7681.3 7705.8 7764.0 7770.5 7820.7 6976.4 7180.7 7186.4 7239.2 7267.7 7137.2 7162.7 7173.9 7173.9 7223.0 6009.2 6049.3 6084.3 6094.4 6118.8 4364.6 4375.1 4397.7 4456.6 4486.3 4561.7 4604.5 4642.8 4661.0 4673.1 12:19:04 INFO - PROCESS | 26515 | 12:19:04 INFO - PROCESS | 26515 | [#4] prototype.html Cycles:180 Average:4290.02 Median:4661.59 stddev:1260.64 (27.0%) stddev-sans-first:1227.75 12:19:04 INFO - PROCESS | 26515 | Values: 281.8 290.7 293.5 293.9 295.7 4939.3 5036.7 5152.7 5216.6 5217.2 5033.4 5067.2 5073.6 5089.4 5103.8 4037.3 4040.6 4042.6 4052.5 4070.0 3985.4 4028.9 4078.4 4088.7 4091.6 4006.0 4011.7 4014.9 4025.3 4032.8 4023.6 4028.7 4032.5 4041.7 4045.8 3558.8 3581.6 3588.7 3602.1 3621.0 4857.7 4998.8 5002.5 5002.7 5081.1 4587.8 4612.3 4627.7 4631.7 4654.7 5353.4 5354.8 5401.3 5422.8 5427.8 3461.4 3661.3 3673.0 3680.9 3879.5 5534.4 5569.8 5598.4 5604.9 5641.2 3712.8 3717.9 3725.8 3735.7 3747.3 3613.7 3774.9 3782.8 3796.0 3803.0 4381.9 4428.8 4439.9 4445.7 4459.1 5322.8 5326.6 5378.5 5378.9 5379.8 1230.2 1291.6 1312.9 1314.9 1323.9 803.5 827.2 836.8 838.6 841.9 4581.1 4595.8 4602.7 4674.3 4707.0 5448.5 5450.9 5469.0 5469.2 5498.5 4558.6 4635.5 4666.9 4672.8 4698.9 2549.3 2579.7 2584.4 2600.8 2633.6 4589.9 4593.3 4605.3 4627.8 4670.6 4656.3 4893.0 4927.3 4927.5 4966.4 4538.2 4562.5 4562.5 4585.2 4631.3 4813.3 4862.0 4863.9 4873.9 4902.7 4563.7 4767.7 4769.7 4812.4 4829.4 4496.3 4539.9 4567.3 4584.5 4599.3 3427.6 3428.7 3431.9 3435.1 3445.9 4839.7 4869.9 4877.3 4912.5 5337.8 5077.2 5347.1 5349.5 5356.9 5368.4 5329.4 5363.2 5374.4 5389.8 5397.4 5155.6 5253.7 5259.7 5288.6 5305.7 5355.6 5392.9 5398.6 5410.4 5420.0 5201.3 5232.4 5272.3 5308.8 5314.7 12:19:04 INFO - PROCESS | 26515 | 12:19:04 INFO - PROCESS | 26515 | [#5] yui.html Cycles:180 Average:18269.41 Median:525.70 stddev:26397.58 (5021.4%) stddev-sans-first:26438.31 12:19:04 INFO - PROCESS | 26515 | Values: 604.5 639.8 644.8 649.3 735.1 12897.5 13788.4 14076.3 14817.3 14887.9 14720.3 14819.7 14876.5 14916.9 14988.0 634.4 777.4 780.3 805.5 806.7 780.6 781.0 782.6 785.2 786.3 830.1 830.9 832.1 833.4 833.7 815.4 825.3 826.2 826.5 828.7 606.9 610.3 610.8 611.0 611.9 14441.1 14525.9 14556.6 14562.8 14602.0 13383.3 13527.9 13719.6 13814.6 13820.4 10043.8 10206.1 10232.6 10272.4 10303.6 3006.2 3058.3 3075.8 3098.1 3106.3 67189.3 67953.3 68923.7 70012.0 70446.6 9730.5 9976.6 10182.1 10194.2 10213.1 15934.4 16323.0 16325.5 16379.8 16492.0 6654.7 6737.3 6833.3 6887.9 7071.2 3850.1 3880.3 3893.6 3954.1 4031.7 2831.8 2939.3 2947.7 2966.9 2972.4 518.5 522.3 525.2 526.2 535.0 538.7 552.2 573.7 580.5 586.9 7980.8 8063.5 8148.9 8176.8 8178.8 574.6 579.8 582.0 603.0 609.2 3861.5 3903.6 3964.5 3972.9 4017.7 74266.0 97769.0 99914.0 101417.5 101608.0 87510.0 88214.6 88941.6 90086.0 92626.5 74071.0 75487.2 78042.6 79813.6 80926.0 7289.7 7348.9 7647.1 7684.0 7709.3 45953.5 47138.8 47920.3 48342.8 48774.3 62955.7 67166.3 67212.0 67305.0 67336.7 9694.6 9706.8 9708.5 9775.6 9802.7 11066.5 11124.9 11856.9 11926.4 12347.6 11178.6 11578.9 12184.5 12226.8 12227.0 10699.7 11066.1 11725.9 12072.5 12164.7 10513.6 10617.3 10921.1 11248.9 11748.7 9815.2 10285.8 10416.6 10553.1 10589.7 9982.6 10150.6 10224.2 10263.6 10672.5 12:19:04 INFO - PROCESS | 26515 | -------- Summary: end -------- 12:19:04 INFO - PROCESS | 26515 | 12:19:05 INFO - TEST-INFO | 26515: exit 0 12:19:05 INFO - TEST-OK | dromaeo_css | took 1116124ms 12:19:05 INFO - TEST-START | kraken 12:19:05 INFO - operating with platform_type : linux_ 12:19:05 INFO - Initialising browser for kraken test... 12:19:05 INFO - TEST-INFO | started process 26756 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpHzuiPP/profile http://localhost:54659/getInfo.html) 12:19:10 INFO - PROCESS | 26756 | __metrics Screen width/height:1600/1200 12:19:10 INFO - PROCESS | 26756 | colorDepth:24 12:19:10 INFO - PROCESS | 26756 | Browser inner width/height: 1024/697 12:19:10 INFO - PROCESS | 26756 | __metrics 12:19:11 ERROR - PROCESS | 26756 | JavaScript error: chrome://browser/content/tabbrowser.xml, line 2968: TypeError: this.tabs is undefined 12:19:12 INFO - TEST-INFO | 26756: exit 0 12:19:12 INFO - Browser initialized. 12:19:12 INFO - Running cycle 1/1 for kraken test... 12:19:12 INFO - TEST-INFO | started process 26876 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpHzuiPP/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 12:19:24 INFO - PROCESS | 26876 | RSS: Main: 169598976 12:19:24 INFO - PROCESS | 26876 | 12:19:26 INFO - PROCESS | 26876 | Cycle 1(1): loaded http://localhost:54659/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:54659/tests/kraken/driver.html?testName=audio-beat-detection) 12:19:27 INFO - PROCESS | 26876 | RSS: Main: 174850048 12:19:27 INFO - PROCESS | 26876 | 12:19:30 INFO - PROCESS | 26876 | Cycle 1(1): loaded http://localhost:54659/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:54659/tests/kraken/driver.html?testName=audio-dft) 12:19:31 INFO - PROCESS | 26876 | RSS: Main: 174702592 12:19:31 INFO - PROCESS | 26876 | 12:19:34 INFO - PROCESS | 26876 | Cycle 1(1): loaded http://localhost:54659/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:54659/tests/kraken/driver.html?testName=audio-fft) 12:19:34 INFO - PROCESS | 26876 | RSS: Main: 169218048 12:19:34 INFO - PROCESS | 26876 | 12:19:36 INFO - PROCESS | 26876 | Cycle 1(1): loaded http://localhost:54659/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:54659/tests/kraken/driver.html?testName=audio-oscillator) 12:19:37 INFO - PROCESS | 26876 | RSS: Main: 169635840 12:19:37 INFO - PROCESS | 26876 | 12:19:39 INFO - PROCESS | 26876 | Cycle 1(1): loaded http://localhost:54659/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:54659/tests/kraken/driver.html?testName=imaging-gaussian-blur) 12:19:40 INFO - PROCESS | 26876 | RSS: Main: 169791488 12:19:40 INFO - PROCESS | 26876 | 12:19:43 INFO - PROCESS | 26876 | Cycle 1(1): loaded http://localhost:54659/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:54659/tests/kraken/driver.html?testName=imaging-darkroom) 12:19:44 INFO - PROCESS | 26876 | RSS: Main: 170741760 12:19:44 INFO - PROCESS | 26876 | 12:19:47 INFO - PROCESS | 26876 | Cycle 1(1): loaded http://localhost:54659/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:54659/tests/kraken/driver.html?testName=imaging-desaturate) 12:19:48 INFO - PROCESS | 26876 | RSS: Main: 167542784 12:19:48 INFO - PROCESS | 26876 | 12:19:51 INFO - PROCESS | 26876 | Cycle 1(1): loaded http://localhost:54659/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:54659/tests/kraken/driver.html?testName=json-parse-financial) 12:19:51 INFO - PROCESS | 26876 | RSS: Main: 169517056 12:19:51 INFO - PROCESS | 26876 | 12:19:53 INFO - PROCESS | 26876 | Cycle 1(1): loaded http://localhost:54659/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:54659/tests/kraken/driver.html?testName=json-stringify-tinderbox) 12:19:54 INFO - PROCESS | 26876 | RSS: Main: 169553920 12:19:54 INFO - PROCESS | 26876 | 12:19:56 INFO - PROCESS | 26876 | Cycle 1(1): loaded http://localhost:54659/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:54659/tests/kraken/driver.html?testName=stanford-crypto-aes) 12:19:56 INFO - PROCESS | 26876 | RSS: Main: 169844736 12:19:56 INFO - PROCESS | 26876 | 12:19:59 INFO - PROCESS | 26876 | Cycle 1(1): loaded http://localhost:54659/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:54659/tests/kraken/driver.html?testName=stanford-crypto-ccm) 12:19:59 INFO - PROCESS | 26876 | RSS: Main: 170160128 12:19:59 INFO - PROCESS | 26876 | 12:20:02 INFO - PROCESS | 26876 | Cycle 1(1): loaded http://localhost:54659/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:54659/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 12:20:03 INFO - PROCESS | 26876 | RSS: Main: 170078208 12:20:03 INFO - PROCESS | 26876 | 12:20:06 INFO - PROCESS | 26876 | Cycle 1(1): loaded http://localhost:54659/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:54659/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 12:20:06 INFO - PROCESS | 26876 | RSS: Main: 170098688 12:20:06 INFO - PROCESS | 26876 | 12:20:08 INFO - PROCESS | 26876 | Cycle 1(1): loaded http://localhost:54659/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:54659/tests/kraken/driver.html?testName=ai-astar) 12:20:08 INFO - PROCESS | 26876 | RSS: Main: 170733568 12:20:08 INFO - PROCESS | 26876 | 12:20:08 INFO - PROCESS | 26876 | __start_tp_report 12:20:08 INFO - PROCESS | 26876 | _x_x_mozilla_page_load 12:20:08 INFO - PROCESS | 26876 | _x_x_mozilla_page_load_details 12:20:08 INFO - PROCESS | 26876 | |i|pagename|runs| 12:20:08 INFO - PROCESS | 26876 | |0;ai-astar;109;115;109;117;117;116;117;115;116;114 12:20:08 INFO - PROCESS | 26876 | |1;audio-beat-detection;152;130;148;180;127;151;158;129;183;123 12:20:08 INFO - PROCESS | 26876 | |2;audio-dft;165;164;164;178;169;166;163;164;165;163 12:20:08 INFO - PROCESS | 26876 | |3;audio-fft;75;76;76;149;76;76;76;75;180;77 12:20:08 INFO - PROCESS | 26876 | |4;audio-oscillator;85;85;136;87;85;84;128;84;84;143 12:20:08 INFO - PROCESS | 26876 | |5;imaging-gaussian-blur;118;118;119;119;118;117;119;118;119;118 12:20:08 INFO - PROCESS | 26876 | |6;imaging-darkroom;148;147;148;149;149;148;148;148;147;148 12:20:08 INFO - PROCESS | 26876 | |7;imaging-desaturate;95;95;95;96;96;95;97;95;96;95 12:20:08 INFO - PROCESS | 26876 | |8;json-parse-financial;66;65;67;65;65;66;72;67;65;70 12:20:08 INFO - PROCESS | 26876 | |9;json-stringify-tinderbox;65;66;65;66;66;67;65;65;69;66 12:20:08 INFO - PROCESS | 26876 | |10;stanford-crypto-aes;80;81;82;81;82;82;80;80;83;79 12:20:08 INFO - PROCESS | 26876 | |11;stanford-crypto-ccm;145;143;138;138;136;130;132;139;175;129 12:20:08 INFO - PROCESS | 26876 | |12;stanford-crypto-pbkdf2;167;171;175;168;165;169;167;169;168;171 12:20:08 INFO - PROCESS | 26876 | |13;stanford-crypto-sha256-iterative;68;68;68;67;68;67;66;70;67;68 12:20:08 INFO - PROCESS | 26876 | __end_tp_report 12:20:08 INFO - PROCESS | 26876 | __start_cc_report 12:20:08 INFO - PROCESS | 26876 | _x_x_mozilla_cycle_collect,1002 12:20:08 INFO - PROCESS | 26876 | __end_cc_report 12:20:08 INFO - PROCESS | 26876 | __startTimestamp1467314408687__endTimestamp 12:20:08 INFO - PROCESS | 26876 | 12:20:08 INFO - PROCESS | 26876 | ------- Summary: start ------- 12:20:08 INFO - PROCESS | 26876 | Number of tests: 14 12:20:08 INFO - PROCESS | 26876 | 12:20:08 INFO - PROCESS | 26876 | [#0] ai-astar Cycles:10 Average:114.50 Median:116.00 stddev:3.06 (2.6%) stddev-sans-first:2.52 12:20:08 INFO - PROCESS | 26876 | Values: 109.0 115.0 109.0 117.0 117.0 116.0 117.0 115.0 116.0 114.0 12:20:08 INFO - PROCESS | 26876 | 12:20:08 INFO - PROCESS | 26876 | [#1] audio-beat-detection Cycles:10 Average:148.10 Median:151.50 stddev:21.41 (14.1%) stddev-sans-first:22.66 12:20:08 INFO - PROCESS | 26876 | Values: 152.0 130.0 148.0 180.0 127.0 151.0 158.0 129.0 183.0 123.0 12:20:08 INFO - PROCESS | 26876 | 12:20:08 INFO - PROCESS | 26876 | [#2] audio-dft Cycles:10 Average:166.10 Median:165.00 stddev:4.53 (2.7%) stddev-sans-first:4.79 12:20:08 INFO - PROCESS | 26876 | Values: 165.0 164.0 164.0 178.0 169.0 166.0 163.0 164.0 165.0 163.0 12:20:08 INFO - PROCESS | 26876 | 12:20:08 INFO - PROCESS | 26876 | [#3] audio-fft Cycles:10 Average:93.60 Median:76.00 stddev:38.08 (50.1%) stddev-sans-first:39.79 12:20:08 INFO - PROCESS | 26876 | Values: 75.0 76.0 76.0 149.0 76.0 76.0 76.0 75.0 180.0 77.0 12:20:08 INFO - PROCESS | 26876 | 12:20:08 INFO - PROCESS | 26876 | [#4] audio-oscillator Cycles:10 Average:100.10 Median:84.50 stddev:24.81 (29.4%) stddev-sans-first:25.71 12:20:08 INFO - PROCESS | 26876 | Values: 85.0 85.0 136.0 87.0 85.0 84.0 128.0 84.0 84.0 143.0 12:20:08 INFO - PROCESS | 26876 | 12:20:08 INFO - PROCESS | 26876 | [#5] imaging-gaussian-blur Cycles:10 Average:118.30 Median:118.50 stddev:0.67 (0.6%) stddev-sans-first:0.71 12:20:08 INFO - PROCESS | 26876 | Values: 118.0 118.0 119.0 119.0 118.0 117.0 119.0 118.0 119.0 118.0 12:20:08 INFO - PROCESS | 26876 | 12:20:08 INFO - PROCESS | 26876 | [#6] imaging-darkroom Cycles:10 Average:148.00 Median:148.00 stddev:0.67 (0.5%) stddev-sans-first:0.71 12:20:08 INFO - PROCESS | 26876 | Values: 148.0 147.0 148.0 149.0 149.0 148.0 148.0 148.0 147.0 148.0 12:20:08 INFO - PROCESS | 26876 | 12:20:08 INFO - PROCESS | 26876 | [#7] imaging-desaturate Cycles:10 Average:95.50 Median:95.50 stddev:0.71 (0.7%) stddev-sans-first:0.73 12:20:08 INFO - PROCESS | 26876 | Values: 95.0 95.0 95.0 96.0 96.0 95.0 97.0 95.0 96.0 95.0 12:20:08 INFO - PROCESS | 26876 | 12:20:08 INFO - PROCESS | 26876 | [#8] json-parse-financial Cycles:10 Average:66.80 Median:66.50 stddev:2.39 (3.6%) stddev-sans-first:2.52 12:20:08 INFO - PROCESS | 26876 | Values: 66.0 65.0 67.0 65.0 65.0 66.0 72.0 67.0 65.0 70.0 12:20:08 INFO - PROCESS | 26876 | 12:20:08 INFO - PROCESS | 26876 | [#9] json-stringify-tinderbox Cycles:10 Average:66.00 Median:66.00 stddev:1.25 (1.9%) stddev-sans-first:1.27 12:20:08 INFO - PROCESS | 26876 | Values: 65.0 66.0 65.0 66.0 66.0 67.0 65.0 65.0 69.0 66.0 12:20:08 INFO - PROCESS | 26876 | 12:20:08 INFO - PROCESS | 26876 | [#10] stanford-crypto-aes Cycles:10 Average:81.00 Median:81.50 stddev:1.25 (1.5%) stddev-sans-first:1.27 12:20:08 INFO - PROCESS | 26876 | Values: 80.0 81.0 82.0 81.0 82.0 82.0 80.0 80.0 83.0 79.0 12:20:08 INFO - PROCESS | 26876 | 12:20:08 INFO - PROCESS | 26876 | [#11] stanford-crypto-ccm Cycles:10 Average:140.50 Median:138.50 stddev:13.19 (9.5%) stddev-sans-first:13.89 12:20:08 INFO - PROCESS | 26876 | Values: 145.0 143.0 138.0 138.0 136.0 130.0 132.0 139.0 175.0 129.0 12:20:08 INFO - PROCESS | 26876 | 12:20:08 INFO - PROCESS | 26876 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:169.00 Median:169.00 stddev:2.79 (1.7%) stddev-sans-first:2.86 12:20:08 INFO - PROCESS | 26876 | Values: 167.0 171.0 175.0 168.0 165.0 169.0 167.0 169.0 168.0 171.0 12:20:08 INFO - PROCESS | 26876 | 12:20:08 INFO - PROCESS | 26876 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:67.70 Median:68.00 stddev:1.06 (1.6%) stddev-sans-first:1.12 12:20:08 INFO - PROCESS | 26876 | Values: 68.0 68.0 68.0 67.0 68.0 67.0 66.0 70.0 67.0 68.0 12:20:08 INFO - PROCESS | 26876 | -------- Summary: end -------- 12:20:08 INFO - PROCESS | 26876 | 12:20:09 INFO - TEST-INFO | 26876: exit 0 12:20:09 INFO - TEST-OK | kraken | took 64123ms 12:20:09 INFO - SUITE-END | took 1180s 12:20:09 INFO - Completed test suite (00:19:40) 12:20:09 INFO - javascript benchmark 12:20:09 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"extraOptions": ["e10s"], "name": "dromaeo_css", "lowerIsBetter": false, "alertThreshold": 5.0, "value": 6414.880431413661, "subtests": [{"name": "dojo.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [2649.496595646827, 2666.9866650666745, 2669.452762183752, 2693.0574298995366, 2693.973060269398, 4686.859394218171, 4724.787384567694, 4741.099191153683, 4797.352357431746, 4828.927566086511, 4666.603338716213, 4806.327114204014, 4883.389576302962, 4884.609231261499, 4903.779329930153, 4373.387725718402, 4392.9560704393025, 4519.751413672247, 4524.049949510607, 4526.253168227255, 4202.159568086379, 4487.685861989662, 4498.662600304974, 4577.908441831161, 4583.587477127058, 4355.716878402894, 4384.145091707119, 4424.3142312941545, 4454.131444368317, 4462.040661257829, 4385.057212699253, 4391.5827996340295, 4445.599896009375, 4445.9110817783785, 4470.642348612103, 4415.359772832921, 4428.977855110704, 4437.4896886858105, 4462.754548499831, 4480.126375356806, 4735.73953432561, 4782.0914026334885, 4787.784549695272, 4801.447833499157, 4808.543188397097, 5090.949090509122, 5093.337866077386, 5097.9490205097845, 5110.616703747234, 5170.715610641413, 5140.460251673558, 5144.6141539384325, 5162.5095615916425, 5166.741662916839, 5166.767495462713, 4816.54242846929, 4820.758962051918, 4822.445418776885, 4828.420589529279, 4864.489228630978, 5322.042032434121, 5326.6005049621435, 5329.1206950852675, 5329.467053294639, 5336.092864213016, 5029.698218106925, 5030.37120359955, 5041.873953151127, 5070.670406423571, 5089.6691715038405, 4957.355543779286, 5137.6660517066275, 5146.742662866842, 5158.690478571298, 5168.8449346519665, 5116.769745361467, 5124.590032797441, 5166.6641668292195, 5182.326297581366, 5185.196294574347, 4899.167141585939, 5105.361829771278, 5143.948560514347, 5167.0, 5207.7916883325, 4364.301711726109, 4364.956350436455, 4369.235383807821, 4378.6278166356215, 4409.11817636474, 3731.1604888900324, 3829.463875057494, 3846.4999550058874, 3847.153626202231, 3879.049632839916, 4541.159885421208, 4547.636189104864, 4567.36056952027, 4598.448186217675, 4602.953970460252, 5253.632245742838, 5270.183121616155, 5303.602229832778, 5306.548943339782, 5353.063213937546, 4470.619997300201, 4542.318652202196, 4581.725096494221, 4605.884852878705, 4630.745309008037, 4669.883252918704, 4694.413198350207, 4708.364370809965, 4713.858584242478, 4756.7145971241835, 4904.5340692634145, 4920.237363208708, 4926.531979461945, 4929.13740095489, 4957.182064959241, 5061.291419201389, 5159.355080614923, 5193.922091168711, 5244.396894357198, 5307.41618421981, 4867.513248675245, 4900.852974410774, 4905.730184839726, 4943.209086546135, 4946.282788995503, 5108.106081435808, 5116.539511443988, 5118.129917913889, 5124.282600435868, 5132.8460146195675, 5105.18317069282, 5138.3063286457345, 5155.046316431472, 5186.58507319406, 5233.842984710464, 4808.903821923612, 4870.05034018363, 5026.74866256693, 5058.241263810458, 5092.41437234708, 5086.0, 5096.05722941257, 5097.7706003229205, 5129.769160387867, 5172.250023746611, 4755.928661070017, 4905.533974272438, 4978.8755281118265, 5028.220625803006, 5047.041062198171, 5047.899042019212, 5097.2608971698155, 5105.055564720538, 5107.157319042316, 5127.87180320495, 4981.252812078217, 4992.700437973734, 5005.174146265826, 5016.072026675077, 5031.823886163967], "value": 4753.0137121557655, "unit": "score"}, {"name": "ext.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [514.9716765577891, 563.4140493886358, 565.6888711208836, 576.0638961687258, 581.816727730765, 40320.0, 41918.16163676725, 41955.58044419555, 42026.57973420265, 45986.31020534686, 43448.13103737924, 43621.345679814825, 43882.56117438833, 44031.779841100826, 44117.33823992643, 7854.960725196366, 7987.121416644164, 8012.5593092379895, 8014.919850801476, 8032.638531266078, 7778.53328800271, 7853.253940875607, 7889.447738658297, 7890.447668663196, 7896.80257993549, 7818.609069546528, 7885.093214280345, 7915.960420197891, 7928.0, 7936.246056624612, 7834.138244793096, 7860.0, 7932.5240485570475, 7934.246246606564, 7935.563544005077, 7869.685212591489, 7909.446338756289, 7971.960140199262, 7979.56112413817, 7991.840163196762, 40456.59543404558, 40838.38742418866, 40984.590154098376, 41010.38484422736, 41061.58938410637, 3088.9536656950163, 3121.1884909923356, 3131.4676504994204, 3180.522921561784, 3198.952015719766, 29984.250393740112, 30015.69984300151, 30038.69961300381, 30412.0, 31077.223069423446, 3400.4219282721997, 3423.1955490459973, 3429.9828500857584, 3433.639467855889, 3471.6528347165336, 260313.0, 261831.0, 261944.6902765493, 262001.0, 262381.0, 32574.511382329285, 55255.44744552583, 55634.44365556374, 55852.16221756677, 56030.719846400505, 33237.667623323454, 35355.292894141974, 35472.0, 35526.0, 35548.46677299843, 12924.483020679256, 13119.540816071583, 13119.868801311864, 13125.737485250433, 13151.802722959163, 10635.94682026585, 10650.680479585624, 10689.518971646294, 10701.946490267655, 10712.571497140027, 7991.800204994805, 8037.879431808527, 8073.273405393543, 8108.310793582612, 8136.593170341459, 3133.498640217554, 3170.128214740919, 3173.809571425722, 3178.491441369416, 3190.9361812763614, 882.6778225947611, 889.5552223887927, 919.5402298850574, 1022.2077889635443, 1026.5370754613914, 29215.0, 29291.121266362043, 29460.705392946224, 29692.0, 29829.10512684623, 966.7293157915794, 980.4460479828874, 1006.8942761009988, 1022.0, 1036.6319956415514, 14714.484993025408, 15105.3202605883, 15163.393464261306, 15269.465568705042, 15429.228538573027, 405612.0, 409240.0, 409565.0, 410575.0, 411511.0, 52208.216876746876, 52808.47191528112, 52842.73578632082, 52947.47052529502, 53049.0, 1158.6697791129488, 1178.1752773058893, 1215.8419405477232, 1219.6828824505692, 1230.7907655698552, 26988.0, 28281.292967675974, 28345.0, 28707.569386458803, 28768.568471472525, 43851.0, 44387.0, 44423.77788111168, 44670.0, 44764.32853507265, 331714.0, 333963.0, 334448.0, 335618.0, 339082.0, 26241.21276361712, 26457.867710661325, 26912.0, 26934.730652693223, 27100.72899270982, 44479.77760111179, 44601.54691491999, 44817.0, 45289.0, 45680.54319456763, 37660.811695941346, 38157.0, 39012.2197556053, 39160.2167956645, 39409.211815764094, 36924.0, 38397.6160238394, 38501.0, 38738.4189237156, 39234.803825980685, 36707.0, 37668.62331376651, 37808.24383512369, 37977.4303385455, 38114.237715244984, 32440.0, 33615.495767563014, 34038.0, 34258.314833703684, 34678.82660586681, 26469.33826654349, 26557.336066597716, 26577.46845063049, 26657.866710666323, 27014.459710806066], "value": 17013.855854226407, "unit": "score"}, {"name": "jquery.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [370.99072523186925, 371.54856848928546, 373.60771190250233, 382.7703377973215, 388.8813911756913, 16755.0, 17107.572310692238, 17482.300707971666, 17517.299308027694, 17541.82458175418, 15831.366745330173, 15930.681386372265, 16774.161291935387, 16806.747898781527, 16814.32742690291, 4745.786439610209, 4851.63612729045, 4868.318435419044, 4880.341153944225, 4886.071646387175, 3407.250404910928, 5928.288605367362, 6232.034034724625, 6243.968780156116, 6367.4906007519285, 5428.972855135718, 6077.63534187948, 6173.444390004899, 6284.183056202687, 6299.590526615778, 5247.0, 5380.085385484477, 5386.407495175527, 5392.946070539284, 5402.594805389592, 4635.745034023127, 4931.43288521821, 5228.2680424740565, 5241.135212689902, 5242.842714718565, 12100.0, 12280.570180043656, 12302.630921072292, 12334.629961101182, 17143.485695429157, 2005.9097340619708, 2033.8169564739244, 2037.022229329915, 2074.294739788479, 2371.3004663624274, 9023.639054437881, 9033.638654453815, 9123.908760912438, 9246.075392460767, 9328.766780830465, 1683.7474378843149, 1719.2177559210654, 1734.2889415339775, 1761.6652835961254, 1794.3181590995468, 67137.0, 73054.0, 73717.26282737158, 74497.62751186264, 74766.25233747647, 9570.186534144537, 9737.756556086013, 9885.851712224323, 9972.551235194434, 10063.446510441996, 13268.40292186854, 13334.733305333839, 13361.73276534464, 13385.129966552144, 13396.995225357941, 7002.579845209304, 7098.219195888448, 7104.964475177591, 7183.5330703504105, 7299.0, 6638.535302528777, 6695.832604184837, 6794.898076528856, 6805.3875151236625, 7021.403180729593, 3797.715171362159, 4175.707700460938, 4250.171216612793, 4283.721558098714, 4373.978130109329, 1685.9241334139747, 1816.5013863562613, 1818.9818101819078, 1822.2801993212606, 1827.6801559726994, 783.3693876429415, 842.9578521074044, 846.1622993236651, 862.2369203255039, 870.9303255739526, 16566.337346506003, 16979.91510042442, 17109.657806843792, 17694.82305176932, 17979.550511237325, 858.5964596639569, 867.7179916527153, 880.2605811118563, 889.6708217959267, 892.4238072126856, 9970.351927124859, 9973.451460169761, 10017.148542373834, 10041.849372259421, 10056.798864022825, 345489.0, 346103.0, 399446.0, 413032.0, 415644.0, 83934.58032709797, 84617.0, 85746.57126714327, 86789.0, 86844.0, 909.5725009245645, 916.6333466613409, 927.9211267042377, 931.5621657820814, 959.0170075672492, 12736.299503527025, 15465.917385783338, 15895.125768082866, 15938.804589656054, 16282.837171628606, 35131.64868351284, 35786.0, 36892.81553592215, 40176.39735403913, 40190.19619607533, 49344.259836101766, 50086.749566251936, 54327.45672543224, 54717.0, 55317.723411382685, 7668.846623067619, 7947.960260198894, 7961.243681850215, 8012.31895288907, 8038.799030024296, 8670.609822558126, 10488.0, 11536.711582210512, 11747.118966077749, 11879.10906681985, 5259.8422047338645, 10214.08073273409, 10259.281850270709, 10577.471126443494, 10752.247342686249, 10254.948725256625, 10407.791844163226, 10677.839832402366, 10688.091512221548, 10810.67567972962, 10255.58977640886, 10551.0, 10591.152707783513, 10623.946880265548, 10682.679519614425, 6625.668716564249, 6946.097007389007, 7730.420218483524, 7740.729074482366, 7793.181715919747, 10013.299069065095, 10409.68770936873, 10419.63531276432, 10728.946355268174, 10860.456977151269], "value": 8142.131557068133, "unit": "score"}, {"name": "mootools.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [1383.7232553489298, 1409.6757745718485, 1527.7631967045104, 1676.5138109948116, 1730.9999999999993, 7148.142222933256, 7861.489003214794, 7912.406569507281, 8390.580470976449, 8425.199606037431, 8003.559804210766, 8228.629711662974, 8258.710945116922, 8334.249917507423, 8339.29116025137, 2214.1143542582936, 2214.2914267434426, 2234.821214302852, 2238.9812635250923, 2240.7535171131162, 2170.435686721448, 2179.455136215946, 2226.7995880370763, 2240.6639004149347, 2242.8654280743126, 2238.440389902524, 2247.6291411917014, 2250.6624006399006, 2255.2670382125793, 2273.920412785553, 2146.0879126371306, 2152.074607918594, 2161.6541353383464, 2166.674998750192, 2174.2607513445346, 2144.4746037220825, 2147.452399638098, 2161.1679503391306, 2163.8809865457392, 2179.4333473296897, 8251.257386835154, 8321.292690121347, 8374.371922105805, 8384.832303353898, 8387.0, 4512.458504979423, 4524.864254072383, 4550.226461501553, 4552.749598772066, 4555.635549156093, 2871.3826527296524, 2930.7508861746564, 2977.7766667500023, 2983.6867128951367, 3012.0813151988636, 930.3255140023497, 940.9247260219166, 954.4988880837616, 962.6486332488661, 966.9661561845302, 11406.828897566544, 11470.139739519485, 11480.712982175512, 11488.712782180346, 11509.539618415254, 4073.5315438724924, 4168.791560421967, 4337.457817772778, 4351.390805287262, 4361.411209486742, 9629.133377995873, 9637.614495420245, 9639.807203855884, 9689.612415503301, 9707.126358627616, 4507.4365704286965, 4577.496475387705, 4585.885352866138, 4618.330342100377, 4619.1685496610935, 3701.1857391373856, 4092.508898932147, 4160.313548264563, 4174.5616710245595, 4230.048239146229, 3720.813959302024, 3723.0, 3726.4037753959237, 3822.7132965027736, 3852.556955950102, 1168.5325869652206, 1193.570314686712, 1193.886580774825, 1194.1640851404052, 1204.3917821500086, 664.9135612370458, 726.989095163573, 750.8761054425959, 761.3034073822502, 776.0183368039435, 4925.532074452921, 5059.873503162376, 5109.897802043938, 5143.871403214875, 5196.272521846944, 382.2622338885977, 386.9883903482844, 387.60077120565296, 389.96880249580533, 398.8384704194806, 3507.649235076472, 3589.6230895756094, 3652.342578335872, 3672.13704779382, 3697.0942119180972, 9981.0, 10128.898711012944, 10265.435401052864, 10409.9479502602, 10472.73818154537, 10220.080192782685, 10281.897181028095, 10324.741881452874, 10342.896571034193, 10353.844692329621, 7546.094468663796, 7612.086549614081, 7653.387728981556, 7719.34385577221, 7763.301302882767, 5210.374755029421, 5263.394709608444, 5311.681299122065, 5325.680459172462, 5335.146376579729, 9163.541822908961, 9482.38364506305, 9584.856227156737, 9598.42409455407, 9600.567974441026, 9403.858942115738, 9569.043095690375, 9715.951420242853, 9767.755806104904, 9788.804223915624, 6926.445884329342, 6992.405645520188, 7024.964875175591, 7029.05107810439, 7031.859362812817, 7681.270279323456, 7705.768826935201, 7763.961180194063, 7770.45606807518, 7820.726274580363, 6976.441884649317, 7180.712771489082, 7186.389156921511, 7239.203687594255, 7267.672954717156, 7137.2149063604, 7162.7069941786685, 7173.892391614026, 7173.928260717535, 7223.0, 6009.2188015557695, 6049.334573197033, 6084.300305464928, 6094.39056094387, 6118.816435506942, 4364.62900653448, 4375.081232941118, 4397.670174736843, 4456.5766252205985, 4486.2597671383855, 4561.657875659273, 4604.516525764747, 4642.791074401727, 4660.953390466052, 4673.112108699336], "value": 4136.870166361501, "unit": "score"}, {"name": "prototype.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [281.76754177803303, 290.7426927169455, 293.48053944518216, 293.90448104366084, 295.71906688645794, 4939.28380384844, 5036.7481625918645, 5152.742362881855, 5216.5826733861295, 5217.165253559431, 5033.395992480908, 5067.189249720045, 5073.619478539115, 5089.353536161194, 5103.8468845934685, 4037.253108174997, 4040.5757395473493, 4042.5957404259634, 4052.4731784868072, 4069.9796501017454, 3985.3623420252766, 4028.858989935353, 4078.4086307485395, 4088.652464540503, 4091.6317531422164, 4005.9799701001452, 4011.653182888014, 4014.919701605966, 4025.2553277643583, 4032.8386864525382, 4023.5976402359825, 4028.738132021424, 4032.475778148851, 4041.6968727345566, 4045.7977101144825, 3558.839852206657, 3581.5881173665102, 3588.6770190682964, 3602.0994751312173, 3620.981895090508, 4857.708537487762, 4998.775055122528, 5002.549770520671, 5002.74986250686, 5081.136206844845, 4587.7706114694465, 4612.285095810154, 4627.722336659811, 4631.698939568951, 4654.720716757005, 5353.38436079848, 5354.812581559627, 5401.297831281948, 5422.8373148805595, 5427.810026649048, 3461.394256005189, 3661.3043521730788, 3672.9632703672887, 3680.926381472382, 3879.515060617423, 5534.418886016951, 5569.832905012856, 5598.412166722517, 5604.859878503029, 5641.2384328116, 3712.7957962311793, 3717.9442308365396, 3725.832337544817, 3735.6824669902817, 3747.3254814133716, 3613.674769270778, 3774.9433758493647, 3782.8108594570713, 3796.0, 3802.961970380316, 4381.868543943623, 4428.800703968329, 4439.912221505687, 4445.666300109954, 4459.130469558405, 5322.840314790563, 5326.627136100436, 5378.462153784591, 5378.91931621026, 5379.784808607612, 1230.2249582762981, 1291.593148158346, 1312.9015323850558, 1314.9013823963242, 1323.8940884729197, 803.493798906685, 827.185222555782, 836.824266903957, 838.5681374092347, 841.886345343383, 4581.106684196549, 4595.816167353335, 4602.746848923274, 4674.345591617176, 4707.03505781314, 5448.482394172547, 5450.937067271844, 5469.042917489423, 5469.206964990054, 5498.505134537831, 4558.566936141061, 4635.536446355338, 4666.906661866744, 4672.836450724209, 4698.906021879611, 2549.3244290263096, 2579.7291284414864, 2584.3539115221197, 2600.765931066213, 2633.6305121336795, 4589.908201835945, 4593.26507758757, 4605.286180642006, 4627.814887404534, 4670.6497012724185, 4656.278276867091, 4892.975535122301, 4927.28554359623, 4927.507249275044, 4966.354373931365, 4538.228501154812, 4562.452505699337, 4562.520935301812, 4585.220512512814, 4631.258998560214, 4813.302071199586, 4862.0341591629785, 4863.927041094315, 4873.853784386474, 4902.7058376497525, 4563.703359281636, 4767.737774422301, 4769.73766442849, 4812.411904071718, 4829.396325459317, 4496.348029535764, 4539.892620801598, 4567.314902764612, 4584.518625544403, 4599.264117741145, 3427.5715535558056, 3428.657134286651, 3431.879884204041, 3435.1068722131927, 3445.87939422119, 4839.661223714447, 4869.926951095666, 4877.292792545132, 4912.484189160086, 5337.786488540571, 5077.1876499759865, 5347.117725575392, 5349.518543331119, 5356.946430535645, 5368.409474957673, 5329.440408757025, 5363.222332761806, 5374.355077390738, 5389.8113566025, 5397.379301380392, 5155.561777248976, 5253.737313134252, 5259.738961843682, 5288.629795914249, 5305.65513241638, 5355.60754203902, 5392.892142157057, 5398.568114550905, 5410.3778065522965, 5419.972900135474, 5201.349831271091, 5232.424433312409, 5272.261883336413, 5308.761105750174, 5314.734263286898], "value": 3880.0218053429207, "unit": "score"}, {"name": "yui.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [604.5496105401477, 639.8240483866936, 644.7743289848556, 649.2987573420706, 735.1362149474367, 12897.484100635975, 13788.379522921468, 14076.296185190751, 14817.333220005099, 14887.925560372183, 14720.26398680067, 14819.703605927874, 14876.47932322369, 14916.850831491682, 14988.0, 634.3878157577936, 777.4091690315373, 780.2821404308036, 805.4844899264447, 806.7176488229131, 780.6292011294646, 780.9531428114303, 782.6008735544856, 785.1755656560617, 786.3159051625095, 830.0869044051556, 830.8961379827522, 832.0930186097153, 833.3541505333385, 833.6665333866441, 815.3925325632412, 825.3397282174236, 826.1944604011101, 826.5454000299811, 828.6892415344277, 606.884691908536, 610.3012051201349, 610.7709608896664, 610.9511239100862, 611.9020956646915, 14441.133531988009, 14525.854741452556, 14556.563303100924, 14562.781558276634, 14602.0, 13383.263920484369, 13527.864721352758, 13719.612721441179, 13814.585562433143, 13820.447182112703, 10043.849342259871, 10206.081452669221, 10232.641857535025, 10272.435016074112, 10303.639372621923, 3006.2484378905274, 3058.3118798270434, 3075.784695071346, 3098.1325228935934, 3106.285554322496, 67189.32810671879, 67953.32046679569, 68923.65538172328, 70012.0, 70446.64776676084, 9730.464824434583, 9976.551055202533, 10182.134518566005, 10194.184465242763, 10213.131883789812, 15934.362625495081, 16323.0, 16325.510234692978, 16379.754303685455, 16492.0, 6654.733810647616, 6737.258901520829, 6833.282505336968, 6887.931120688829, 7071.151461824614, 3850.0567360996174, 3880.3015457217407, 3893.5717071122153, 3954.149857780591, 4031.677465802729, 2831.7734581233863, 2939.3092623233524, 2947.7494412974706, 2966.8961586344376, 2972.4203780263074, 518.4582111693289, 522.3261992030315, 525.1545012529824, 526.2474661234395, 534.981275655358, 538.733327003136, 552.1827695011325, 573.7332140554662, 580.4833698008775, 586.8591538030927, 7980.760577182694, 8063.475874068166, 8148.877766833502, 8176.7955801105445, 8178.836423271501, 574.6408494690818, 579.7883772423036, 582.022202699469, 602.9879402411927, 609.2141137932018, 3861.4860476966387, 3903.6291552302487, 3964.5440774310746, 3972.900677483086, 4017.658499027557, 74266.0, 97769.0, 99914.0, 101417.49291253496, 101608.0, 87510.0, 88214.55892720495, 88941.55529222313, 90086.0, 92626.53686731523, 74071.0, 75487.24512754912, 78042.6097869507, 79813.60093199497, 80926.0, 7289.671964761705, 7348.926510735038, 7647.120581133018, 7684.001079859582, 7709.306162445182, 45953.54046459626, 47138.76430617825, 47920.28119578279, 48342.75828620975, 48774.268385973526, 62955.6852215736, 67166.328336716, 67212.0, 67305.0, 67336.6633166831, 9694.6122155113, 9706.75733106678, 9708.5145742714, 9775.608975641178, 9802.705918822447, 11066.502007409525, 11124.888751112385, 11856.940715296714, 11926.403679816149, 12347.62957111288, 11178.552857885594, 11578.94210528942, 12184.451699673358, 12226.816597751218, 12227.0, 10699.743404301742, 11066.114710822954, 11725.88274117248, 12072.517099315928, 12164.695882603006, 10513.632022879163, 10617.309874858109, 10921.071708904514, 11248.88751112511, 11748.70628234301, 9815.2147828175, 10285.794284114127, 10416.583336666448, 10553.102986245947, 10589.682309530726, 9982.60069597208, 10150.644727434505, 10224.233182511192, 10263.640772572924, 10672.46637668129], "value": 6592.780293099897, "unit": "score"}]}, {"extraOptions": ["e10s"], "name": "kraken", "lowerIsBetter": true, "alertThreshold": 2.0, "value": 1575.2, "subtests": [{"name": "ai-astar", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [109.0, 115.0, 109.0, 117.0, 117.0, 116.0, 117.0, 115.0, 116.0, 114.0], "value": 114.5, "unit": "score"}, {"name": "audio-beat-detection", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [152.0, 130.0, 148.0, 180.0, 127.0, 151.0, 158.0, 129.0, 183.0, 123.0], "value": 148.1, "unit": "score"}, {"name": "audio-dft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [165.0, 164.0, 164.0, 178.0, 169.0, 166.0, 163.0, 164.0, 165.0, 163.0], "value": 166.1, "unit": "score"}, {"name": "audio-fft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [75.0, 76.0, 76.0, 149.0, 76.0, 76.0, 76.0, 75.0, 180.0, 77.0], "value": 93.6, "unit": "score"}, {"name": "audio-oscillator", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [85.0, 85.0, 136.0, 87.0, 85.0, 84.0, 128.0, 84.0, 84.0, 143.0], "value": 100.1, "unit": "score"}, {"name": "imaging-gaussian-blur", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [118.0, 118.0, 119.0, 119.0, 118.0, 117.0, 119.0, 118.0, 119.0, 118.0], "value": 118.3, "unit": "score"}, {"name": "imaging-darkroom", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [148.0, 147.0, 148.0, 149.0, 149.0, 148.0, 148.0, 148.0, 147.0, 148.0], "value": 148.0, "unit": "score"}, {"name": "imaging-desaturate", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [95.0, 95.0, 95.0, 96.0, 96.0, 95.0, 97.0, 95.0, 96.0, 95.0], "value": 95.5, "unit": "score"}, {"name": "json-parse-financial", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [66.0, 65.0, 67.0, 65.0, 65.0, 66.0, 72.0, 67.0, 65.0, 70.0], "value": 66.8, "unit": "score"}, {"name": "json-stringify-tinderbox", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [65.0, 66.0, 65.0, 66.0, 66.0, 67.0, 65.0, 65.0, 69.0, 66.0], "value": 66.0, "unit": "score"}, {"name": "stanford-crypto-aes", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [80.0, 81.0, 82.0, 81.0, 82.0, 82.0, 80.0, 80.0, 83.0, 79.0], "value": 81.0, "unit": "score"}, {"name": "stanford-crypto-ccm", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [145.0, 143.0, 138.0, 138.0, 136.0, 130.0, 132.0, 139.0, 175.0, 129.0], "value": 140.5, "unit": "score"}, {"name": "stanford-crypto-pbkdf2", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [167.0, 171.0, 175.0, 168.0, 165.0, 169.0, 167.0, 169.0, 168.0, 171.0], "value": 169.0, "unit": "score"}, {"name": "stanford-crypto-sha256-iterative", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [68.0, 68.0, 68.0, 67.0, 68.0, 67.0, 66.0, 70.0, 67.0, 68.0], "value": 67.7, "unit": "score"}]}]} 12:20:09 INFO - Return code: 0 12:20:09 INFO - Validating PERFHERDER_DATA against /builds/slave/test/scripts/external_tools/performance-artifact-schema.json 12:20:09 ERROR - # TBPL SUCCESS # 12:20:09 INFO - Running post-action listener: _resource_record_post_action 12:20:09 INFO - ##### 12:20:09 INFO - ##### Finished run-tests step (success) 12:20:09 INFO - ##### 12:20:09 INFO - Running post-run listener: _resource_record_post_run 12:20:10 INFO - Total resource usage - Wall time: 1197s; CPU: 13.0%; Read bytes: 4096; Write bytes: 547352576; Read time: 8; Write time: 497528 12:20:10 INFO - TinderboxPrint: CPU usage
13.4% 12:20:10 INFO - TinderboxPrint: I/O read bytes / time
4,096 / 8 12:20:10 INFO - TinderboxPrint: I/O write bytes / time
547,352,576 / 497,528 12:20:10 INFO - TinderboxPrint: CPU idle
8,272.6 (86.6%) 12:20:10 INFO - TinderboxPrint: CPU user
1,225.4 (12.8%) 12:20:10 INFO - TinderboxPrint: Swap in / out
0 / 0 12:20:10 INFO - install - Wall time: 17s; CPU: 14.0%; Read bytes: 0; Write bytes: 245776384; Read time: 0; Write time: 264644 12:20:10 INFO - run-tests - Wall time: 1181s; CPU: 13.0%; Read bytes: 0; Write bytes: 300961792; Read time: 0; Write time: 232768 12:20:10 INFO - Running post-run listener: _upload_blobber_files 12:20:10 INFO - Blob upload gear active. 12:20:10 INFO - Preparing to upload files from /builds/slave/test/build/blobber_upload_dir. 12:20:10 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 12:20:10 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', 'Autoland-Non-PGO', '-d', '/builds/slave/test/build/blobber_upload_dir', '--output-manifest', '/builds/slave/test/build/uploaded_files.json'] 12:20:10 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 Autoland-Non-PGO -d /builds/slave/test/build/blobber_upload_dir --output-manifest /builds/slave/test/build/uploaded_files.json 12:20:11 INFO - (blobuploader) - INFO - Open directory for files ... 12:20:11 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log ... 12:20:11 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 12:20:11 INFO - (blobuploader) - INFO - Uploading, attempt #1. 12:20:11 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_errorsummary.log: uploaded 12:20:11 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 12:20:11 INFO - (blobuploader) - INFO - Done attempting. 12:20:11 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log ... 12:20:11 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 12:20:11 INFO - (blobuploader) - INFO - Uploading, attempt #1. 12:20:12 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_raw.log: uploaded 12:20:12 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 12:20:12 INFO - (blobuploader) - INFO - Done attempting. 12:20:12 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/resource-usage.json ... 12:20:12 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 12:20:12 INFO - (blobuploader) - INFO - Uploading, attempt #1. 12:20:16 INFO - (blobuploader) - INFO - TinderboxPrint: resource-usage.json: uploaded 12:20:16 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 12:20:16 INFO - (blobuploader) - INFO - Done attempting. 12:20:16 INFO - (blobuploader) - INFO - Iteration through files over. 12:20:16 INFO - Return code: 0 12:20:16 INFO - rmtree: /builds/slave/test/build/uploaded_files.json 12:20:16 INFO - retry: Calling remove with args: ('/builds/slave/test/build/uploaded_files.json',), kwargs: {}, attempt #1 12:20:16 INFO - Setting buildbot property blobber_files to {"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Autoland-Non-PGO/sha512/353ffa6f6311cd290eb4f4bd5b16f86f76d65779fe3f252b3c2a5662712261e4b52e6b3c0959257c35f0b7fcd1018ff3955519de35257bf047c54aba2a2397d4", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Autoland-Non-PGO/sha512/8b4e7feab3c8213f2af9d6aaa3904161456f12070645819d05a430b9983593e16b06192ba40efb4738086a42aefb0406e48a1b97bd254b7490e410087e720fab", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Autoland-Non-PGO/sha512/25baefb2b7775be98cd06515355c94bfdd5a809fa73c3021a7692ed648149d7501b04976b1e0dd623aa493ee6ebdee993d35e3b019d592c79063063d3ee907a1"} 12:20:16 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test/properties/blobber_files 12:20:16 INFO - Writing to file /builds/slave/test/properties/blobber_files 12:20:16 INFO - Contents: 12:20:16 INFO - blobber_files:{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Autoland-Non-PGO/sha512/353ffa6f6311cd290eb4f4bd5b16f86f76d65779fe3f252b3c2a5662712261e4b52e6b3c0959257c35f0b7fcd1018ff3955519de35257bf047c54aba2a2397d4", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Autoland-Non-PGO/sha512/8b4e7feab3c8213f2af9d6aaa3904161456f12070645819d05a430b9983593e16b06192ba40efb4738086a42aefb0406e48a1b97bd254b7490e410087e720fab", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Autoland-Non-PGO/sha512/25baefb2b7775be98cd06515355c94bfdd5a809fa73c3021a7692ed648149d7501b04976b1e0dd623aa493ee6ebdee993d35e3b019d592c79063063d3ee907a1"} 12:20:16 INFO - Running post-run listener: copy_logs_to_upload_dir 12:20:16 INFO - Copying logs to upload dir... 12:20:16 INFO - mkdir: /builds/slave/test/build/upload/logs 12:20:16 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1257.371922 ========= master_lag: 0.03 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 57 secs) (at 2016-06-30 12:20:16.407263) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-06-30 12:20:16.411747) ========= 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=c6927cf182745ad25b1d38b9000001fe-1467308939.208533-281882626 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/Autoland-Non-PGO/sha512/353ffa6f6311cd290eb4f4bd5b16f86f76d65779fe3f252b3c2a5662712261e4b52e6b3c0959257c35f0b7fcd1018ff3955519de35257bf047c54aba2a2397d4", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Autoland-Non-PGO/sha512/8b4e7feab3c8213f2af9d6aaa3904161456f12070645819d05a430b9983593e16b06192ba40efb4738086a42aefb0406e48a1b97bd254b7490e410087e720fab", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Autoland-Non-PGO/sha512/25baefb2b7775be98cd06515355c94bfdd5a809fa73c3021a7692ed648149d7501b04976b1e0dd623aa493ee6ebdee993d35e3b019d592c79063063d3ee907a1"} build_url:https://queue.taskcluster.net/v1/task/UOlgP3uLQCa0cXZY2usHCA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 program finished with exit code 0 elapsedTime=0.011265 build_url: 'https://queue.taskcluster.net/v1/task/UOlgP3uLQCa0cXZY2usHCA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2' blobber_files: '{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Autoland-Non-PGO/sha512/353ffa6f6311cd290eb4f4bd5b16f86f76d65779fe3f252b3c2a5662712261e4b52e6b3c0959257c35f0b7fcd1018ff3955519de35257bf047c54aba2a2397d4", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Autoland-Non-PGO/sha512/8b4e7feab3c8213f2af9d6aaa3904161456f12070645819d05a430b9983593e16b06192ba40efb4738086a42aefb0406e48a1b97bd254b7490e410087e720fab", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Autoland-Non-PGO/sha512/25baefb2b7775be98cd06515355c94bfdd5a809fa73c3021a7692ed648149d7501b04976b1e0dd623aa493ee6ebdee993d35e3b019d592c79063063d3ee907a1"}' ========= master_lag: 0.02 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-06-30 12:20:16.441049) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-06-30 12:20:16.441415) ========= 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=c6927cf182745ad25b1d38b9000001fe-1467308939.208533-281882626 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004381 ========= master_lag: 0.08 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-06-30 12:20:16.523302) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2016-06-30 12:20:16.523629) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2016-06-30 12:20:16.523967) ========= ========= Total master_lag: 0.22 =========