builder: mozilla-central_ubuntu64_hw_test-dromaeojs slave: talos-linux64-ix-013 starttime: 1467455344.59 results: success (0) buildid: 20160702021622 builduid: db25b141bf5e417ab9dc2b107658f7d3 revision: 39dffbba764210b25bfc1e749b4f16db77fa0d46 ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2016-07-02 03:29:04.590628) ========= master: http://buildbot-master104.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2016-07-02 03:29:04.591123) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-07-02 03:29:04.591433) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-07-02 03:29:04.619236) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-07-02 03:29:04.619650) ========= 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=9c3a94c35cc88655b05d2c08000001b2-1467454824.188659-1286726705 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2016-07-02 03:29:04-- 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% 21.0M=0.001s 2016-07-02 03:29:05 (21.0 MB/s) - `archiver_client.py' saved [12141/12141] program finished with exit code 0 elapsedTime=0.089364 ========= master_lag: 0.05 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-07-02 03:29:04.761303) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-07-02 03:29:04.761654) ========= 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=9c3a94c35cc88655b05d2c08000001b2-1467454824.188659-1286726705 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.023447 ========= master_lag: 0.03 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-07-02 03:29:04.813434) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-07-02 03:29:04.813947) ========= bash -c 'python archiver_client.py mozharness --repo mozilla-central --rev 39dffbba764210b25bfc1e749b4f16db77fa0d46 --destination scripts --debug' in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', u'python archiver_client.py mozharness --repo mozilla-central --rev 39dffbba764210b25bfc1e749b4f16db77fa0d46 --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=9c3a94c35cc88655b05d2c08000001b2-1467454824.188659-1286726705 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2016-07-02 03:29:05,219 truncating revision to first 12 chars 2016-07-02 03:29:05,219 Setting DEBUG logging. 2016-07-02 03:29:05,219 attempt 1/10 2016-07-02 03:29:05,219 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/mozilla-central/39dffbba7642?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2016-07-02 03:29:05,686 unpacking tar archive at: mozilla-central-39dffbba7642/testing/mozharness/ program finished with exit code 0 elapsedTime=0.836191 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-07-02 03:29:05.666776) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-07-02 03:29:05.667396) ========= script_repo_revision: 39dffbba764210b25bfc1e749b4f16db77fa0d46 ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-07-02 03:29:05.668196) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-07-02 03:29:05.668620) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-07-02 03:29:05.681806) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 51 secs) (at 2016-07-02 03:29:05.682175) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs --add-option --webServer,localhost --branch-name Firefox-Non-PGO --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Firefox-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', '--add-option', '--webServer,localhost', '--branch-name', 'Firefox-Non-PGO', '--cfg', 'talos/linux_config.py', '--download-symbols', 'ondemand', '--use-talos-json', '--blob-upload-branch', 'Firefox-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=9c3a94c35cc88655b05d2c08000001b2-1467454824.188659-1286726705 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 03:29:06 INFO - MultiFileLogger online at 20160702 03:29:06 in /builds/slave/test 03:29:06 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs --add-option --webServer,localhost --branch-name Firefox-Non-PGO --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Firefox-Non-PGO 03:29:06 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 03:29:06 INFO - {'append_to_log': False, 03:29:06 INFO - 'base_work_dir': '/builds/slave/test', 03:29:06 INFO - 'blob_upload_branch': 'Firefox-Non-PGO', 03:29:06 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 03:29:06 INFO - 'branch': 'Firefox-Non-PGO', 03:29:06 INFO - 'buildbot_json_path': 'buildprops.json', 03:29:06 INFO - 'config_files': ('talos/linux_config.py',), 03:29:06 INFO - 'default_actions': ('clobber', 03:29:06 INFO - 'read-buildbot-config', 03:29:06 INFO - 'download-and-extract', 03:29:06 INFO - 'populate-webroot', 03:29:06 INFO - 'create-virtualenv', 03:29:06 INFO - 'install', 03:29:06 INFO - 'run-tests'), 03:29:06 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 03:29:06 INFO - 'download_minidump_stackwalk': True, 03:29:06 INFO - 'download_symbols': 'ondemand', 03:29:06 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 03:29:06 INFO - 'tooltool.py': '/tools/tooltool.py', 03:29:06 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 03:29:06 INFO - '/tools/misc-python/virtualenv.py')}, 03:29:06 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 03:29:06 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 03:29:06 INFO - 'installer_path': 'installer.exe', 03:29:06 INFO - 'log_level': 'info', 03:29:06 INFO - 'log_name': 'talos', 03:29:06 INFO - 'log_to_console': True, 03:29:06 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 03:29:06 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 03:29:06 INFO - 'opt_config_files': (), 03:29:06 INFO - 'pip_index': False, 03:29:06 INFO - 'sps_profile': False, 03:29:06 INFO - 'sps_profile_interval': 0, 03:29:06 INFO - 'suite': 'dromaeojs', 03:29:06 INFO - 'system_bits': '32', 03:29:06 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 03:29:06 INFO - 'title': 'talos-linux64-ix-013', 03:29:06 INFO - 'tooltool_cache': '/builds/tooltool_cache', 03:29:06 INFO - 'use_talos_json': True, 03:29:06 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 03:29:06 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 03:29:06 INFO - 'work_dir': 'build'} 03:29:06 INFO - ##### 03:29:06 INFO - ##### Running clobber step. 03:29:06 INFO - ##### 03:29:06 INFO - Running pre-action listener: _resource_record_pre_action 03:29:06 INFO - Running main action method: clobber 03:29:06 INFO - rmtree: /builds/slave/test/build 03:29:06 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 03:29:06 INFO - Running post-action listener: _resource_record_post_action 03:29:06 INFO - ##### 03:29:06 INFO - ##### Finished clobber step (success) 03:29:06 INFO - ##### 03:29:06 INFO - ##### 03:29:06 INFO - ##### Running read-buildbot-config step. 03:29:06 INFO - ##### 03:29:06 INFO - Running pre-action listener: _resource_record_pre_action 03:29:06 INFO - Running main action method: read_buildbot_config 03:29:06 INFO - Using buildbot properties: 03:29:06 INFO - { 03:29:06 INFO - "project": "", 03:29:06 INFO - "product": "firefox", 03:29:06 INFO - "script_repo_revision": "production", 03:29:06 INFO - "builddir": "mozilla-central_ubuntu64_hw_test-dromaeojs", 03:29:06 INFO - "repository": "", 03:29:06 INFO - "buildername": "Ubuntu HW 12.04 x64 mozilla-central talos dromaeojs", 03:29:06 INFO - "buildid": "20160702021622", 03:29:06 INFO - "pgo_build": "False", 03:29:06 INFO - "basedir": "/builds/slave/test", 03:29:06 INFO - "buildnumber": 135, 03:29:06 INFO - "slavename": "talos-linux64-ix-013", 03:29:06 INFO - "master": "http://buildbot-master104.bb.releng.scl3.mozilla.com:8201/", 03:29:06 INFO - "platform": "ubuntu64_hw", 03:29:06 INFO - "scheduler": "tests-mozilla-central-linux64-talos", 03:29:06 INFO - "branch": "mozilla-central", 03:29:06 INFO - "repo_path": "mozilla-central", 03:29:06 INFO - "revision": "39dffbba764210b25bfc1e749b4f16db77fa0d46", 03:29:06 INFO - "stage_platform": "linux64", 03:29:06 INFO - "builduid": "db25b141bf5e417ab9dc2b107658f7d3", 03:29:06 INFO - "slavebuilddir": "test" 03:29:06 INFO - } 03:29:06 INFO - Found installer url https://queue.taskcluster.net/v1/task/OP82OBfxQyasCgzP8SZffA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2. 03:29:06 INFO - Running post-action listener: _resource_record_post_action 03:29:06 INFO - ##### 03:29:06 INFO - ##### Finished read-buildbot-config step (success) 03:29:06 INFO - ##### 03:29:06 INFO - ##### 03:29:06 INFO - ##### Running download-and-extract step. 03:29:06 INFO - ##### 03:29:06 INFO - Running pre-action listener: _resource_record_pre_action 03:29:06 INFO - Running main action method: download_and_extract 03:29:06 INFO - mkdir: /builds/slave/test/build/tests 03:29:06 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 03:29:06 INFO - https://queue.taskcluster.net/v1/task/OP82OBfxQyasCgzP8SZffA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.test_packages.json matches https://queue.taskcluster.net 03:29:06 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/OP82OBfxQyasCgzP8SZffA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.test_packages.json 03:29:06 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/OP82OBfxQyasCgzP8SZffA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.test_packages.json 03:29:06 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/OP82OBfxQyasCgzP8SZffA/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 03:29:06 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/OP82OBfxQyasCgzP8SZffA/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 03:29:16 INFO - Downloaded 1361 bytes. 03:29:16 INFO - Reading from file /builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.test_packages.json 03:29:16 INFO - Using the following test package requirements: 03:29:16 INFO - {u'common': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip'], 03:29:16 INFO - u'cppunittest': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 03:29:16 INFO - u'firefox-50.0a1.en-US.linux-x86_64.cppunittest.tests.zip'], 03:29:16 INFO - u'gtest': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 03:29:16 INFO - u'firefox-50.0a1.en-US.linux-x86_64.gtest.tests.zip'], 03:29:16 INFO - u'jittest': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 03:29:16 INFO - u'jsshell-linux-x86_64.zip'], 03:29:16 INFO - u'mochitest': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 03:29:16 INFO - u'firefox-50.0a1.en-US.linux-x86_64.mochitest.tests.zip'], 03:29:16 INFO - u'mozbase': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip'], 03:29:16 INFO - u'reftest': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 03:29:16 INFO - u'firefox-50.0a1.en-US.linux-x86_64.reftest.tests.zip'], 03:29:16 INFO - u'talos': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 03:29:16 INFO - u'firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip'], 03:29:16 INFO - u'web-platform': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 03:29:16 INFO - u'firefox-50.0a1.en-US.linux-x86_64.web-platform.tests.zip'], 03:29:16 INFO - u'xpcshell': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 03:29:16 INFO - u'firefox-50.0a1.en-US.linux-x86_64.xpcshell.tests.zip']} 03:29:16 INFO - Downloading packages: [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip'] for test suite category: common 03:29:16 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')]} 03:29:16 INFO - https://queue.taskcluster.net/v1/task/OP82OBfxQyasCgzP8SZffA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 03:29:16 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/OP82OBfxQyasCgzP8SZffA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip 03:29:16 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/OP82OBfxQyasCgzP8SZffA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip 03:29:16 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/OP82OBfxQyasCgzP8SZffA/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 03:29:16 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/OP82OBfxQyasCgzP8SZffA/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 03:29:21 INFO - Downloaded 22705963 bytes. 03:29:21 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'] 03:29:21 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 03:29:22 INFO - Return code: 0 03:29:22 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 03:29:22 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')]} 03:29:22 INFO - https://queue.taskcluster.net/v1/task/OP82OBfxQyasCgzP8SZffA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 03:29:22 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/OP82OBfxQyasCgzP8SZffA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip 03:29:22 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/OP82OBfxQyasCgzP8SZffA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip 03:29:22 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/OP82OBfxQyasCgzP8SZffA/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 03:29:22 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/OP82OBfxQyasCgzP8SZffA/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 03:29:25 INFO - Downloaded 22705963 bytes. 03:29:25 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'] 03:29:25 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 03:29:26 INFO - Return code: 0 03:29:26 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')]} 03:29:26 INFO - https://queue.taskcluster.net/v1/task/OP82OBfxQyasCgzP8SZffA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip matches https://queue.taskcluster.net 03:29:26 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/OP82OBfxQyasCgzP8SZffA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip 03:29:26 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/OP82OBfxQyasCgzP8SZffA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip 03:29:26 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/OP82OBfxQyasCgzP8SZffA/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 03:29:26 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/OP82OBfxQyasCgzP8SZffA/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 03:29:27 INFO - Downloaded 14405327 bytes. 03:29:27 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'] 03:29:27 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 03:29:27 INFO - Return code: 0 03:29:27 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')]} 03:29:27 INFO - https://queue.taskcluster.net/v1/task/OP82OBfxQyasCgzP8SZffA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 matches https://queue.taskcluster.net 03:29:27 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/OP82OBfxQyasCgzP8SZffA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 03:29:27 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/OP82OBfxQyasCgzP8SZffA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 03:29:27 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/OP82OBfxQyasCgzP8SZffA/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 03:29:27 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/OP82OBfxQyasCgzP8SZffA/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 03:29:29 INFO - Downloaded 56479546 bytes. 03:29:29 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/OP82OBfxQyasCgzP8SZffA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 03:29:29 INFO - mkdir: /builds/slave/test/properties 03:29:29 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 03:29:29 INFO - Writing to file /builds/slave/test/properties/build_url 03:29:29 INFO - Contents: 03:29:29 INFO - build_url:https://queue.taskcluster.net/v1/task/OP82OBfxQyasCgzP8SZffA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 03:29:30 INFO - Running post-action listener: _resource_record_post_action 03:29:30 INFO - Running post-action listener: set_extra_try_arguments 03:29:30 INFO - ##### 03:29:30 INFO - ##### Finished download-and-extract step (success) 03:29:30 INFO - ##### 03:29:30 INFO - ##### 03:29:30 INFO - ##### Running populate-webroot step. 03:29:30 INFO - ##### 03:29:30 INFO - Running pre-action listener: _resource_record_pre_action 03:29:30 INFO - Running main action method: populate_webroot 03:29:30 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 03:29:30 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 03:29:30 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 03:29:30 INFO - '--tppagecycles', 03:29:30 INFO - '7'], 03:29:30 INFO - 'tests': ['tsvgm']}}, 03:29:30 INFO - 'suites': {'chromez': {'talos_options': ['--disable-e10s'], 03:29:30 INFO - 'tests': ['tresize', 'tcanvasmark']}, 03:29:30 INFO - 'chromez-e10s': {'tests': ['tresize', 'tcanvasmark']}, 03:29:30 INFO - 'dromaeojs': {'talos_options': ['--disable-e10s'], 03:29:30 INFO - 'tests': ['dromaeo_css', 'kraken']}, 03:29:30 INFO - 'dromaeojs-e10s': {'tests': ['dromaeo_css', 'kraken']}, 03:29:30 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 03:29:30 INFO - 'talos_options': ['--disable-e10s'], 03:29:30 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 03:29:30 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 03:29:30 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 03:29:30 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 03:29:30 INFO - 'talos_options': ['--disable-e10s'], 03:29:30 INFO - 'tests': ['damp', 'tps']}, 03:29:30 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 03:29:30 INFO - 'tests': ['damp', 'tps']}, 03:29:30 INFO - 'g3': {'talos_options': ['--disable-e10s'], 03:29:30 INFO - 'tests': ['dromaeo_dom']}, 03:29:30 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 03:29:30 INFO - 'g4': {'talos_options': ['--disable-e10s'], 03:29:30 INFO - 'tests': ['basic_compositor_video']}, 03:29:30 INFO - 'g4-e10s': {'tests': ['basic_compositor_video']}, 03:29:30 INFO - 'other': {'talos_options': ['--disable-e10s'], 03:29:30 INFO - 'tests': ['a11yr', 03:29:30 INFO - 'ts_paint', 03:29:30 INFO - 'tpaint', 03:29:30 INFO - 'sessionrestore', 03:29:30 INFO - 'sessionrestore_no_auto_restore', 03:29:30 INFO - 'tabpaint']}, 03:29:30 INFO - 'other-e10s': {'tests': ['a11yr', 03:29:30 INFO - 'ts_paint', 03:29:30 INFO - 'tpaint', 03:29:30 INFO - 'sessionrestore', 03:29:30 INFO - 'sessionrestore_no_auto_restore', 03:29:30 INFO - 'tabpaint']}, 03:29:30 INFO - 'other-e10s_l64': {'tests': ['a11yr', 03:29:30 INFO - 'ts_paint', 03:29:30 INFO - 'tpaint', 03:29:30 INFO - 'sessionrestore', 03:29:30 INFO - 'sessionrestore_no_auto_restore', 03:29:30 INFO - 'tabpaint']}, 03:29:30 INFO - 'other-e10s_nol64': {'tests': ['a11yr', 03:29:30 INFO - 'ts_paint', 03:29:30 INFO - 'tpaint', 03:29:30 INFO - 'sessionrestore', 03:29:30 INFO - 'sessionrestore_no_auto_restore', 03:29:30 INFO - 'tabpaint']}, 03:29:30 INFO - 'other_l64': {'talos_options': ['--disable-e10s'], 03:29:30 INFO - 'tests': ['a11yr', 03:29:30 INFO - 'ts_paint', 03:29:30 INFO - 'tpaint', 03:29:30 INFO - 'sessionrestore', 03:29:30 INFO - 'sessionrestore_no_auto_restore', 03:29:30 INFO - 'tabpaint']}, 03:29:30 INFO - 'other_nol64': {'talos_options': ['--disable-e10s'], 03:29:30 INFO - 'tests': ['a11yr', 03:29:30 INFO - 'ts_paint', 03:29:30 INFO - 'tpaint', 03:29:30 INFO - 'sessionrestore', 03:29:30 INFO - 'sessionrestore_no_auto_restore', 03:29:30 INFO - 'tabpaint']}, 03:29:30 INFO - 'svgr': {'talos_options': ['--disable-e10s'], 03:29:30 INFO - 'tests': ['tsvgx', 03:29:30 INFO - 'tsvgr_opacity', 03:29:30 INFO - 'tart', 03:29:30 INFO - 'tscrollx', 03:29:30 INFO - 'cart']}, 03:29:30 INFO - 'svgr-e10s': {'tests': ['tsvgx', 03:29:30 INFO - 'tsvgr_opacity', 03:29:30 INFO - 'tart', 03:29:30 INFO - 'tscrollx', 03:29:30 INFO - 'cart']}, 03:29:30 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 03:29:30 INFO - 'talos_options': ['--disable-e10s'], 03:29:30 INFO - 'tests': ['tp5o']}, 03:29:30 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 03:29:30 INFO - 'tests': ['tp5o']}, 03:29:30 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 03:29:30 INFO - 'talos_options': ['--disable-e10s', 03:29:30 INFO - '--xperf_path', 03:29:30 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 03:29:30 INFO - 'tests': ['tp5n']}, 03:29:30 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 03:29:30 INFO - 'talos_options': ['--xperf_path', 03:29:30 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 03:29:30 INFO - 'tests': ['tp5n']}}, 03:29:30 INFO - 'talos.zip': {'path': '', 03:29:30 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 03:29:30 INFO - Running post-action listener: _resource_record_post_action 03:29:30 INFO - ##### 03:29:30 INFO - ##### Finished populate-webroot step (success) 03:29:30 INFO - ##### 03:29:30 INFO - ##### 03:29:30 INFO - ##### Running create-virtualenv step. 03:29:30 INFO - ##### 03:29:30 INFO - Running pre-action listener: _resource_record_pre_action 03:29:30 INFO - Running main action method: create_virtualenv 03:29:30 INFO - Creating virtualenv /builds/slave/test/build/venv 03:29:30 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 03:29:30 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 03:29:30 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 03:29:30 INFO - Using real prefix '/usr' 03:29:30 INFO - New python executable in /builds/slave/test/build/venv/bin/python 03:29:30 INFO - Installing distribute.............................................................................................................................................................................................done. 03:29:32 INFO - Installing pip.................done. 03:29:32 INFO - Return code: 0 03:29:32 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 03:29:32 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 03:29:32 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 03:29:32 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:29:32 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 03:29:32 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 03:29:32 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:29:32 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 0xf00030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10638a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x11c1180>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x11bf3b0>, '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 0x11c02b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x11c0740>, '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': '9c3a94c35cc88655b05d2c08000001b2-1467454824.188659-1286726705', '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 03:29:32 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 03:29:32 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 03:29:32 INFO - Using env: {'DISPLAY': ':0', 03:29:32 INFO - 'HOME': '/home/cltbld', 03:29:32 INFO - 'LANG': 'en_US.UTF-8', 03:29:32 INFO - 'LANGUAGE': 'en_US:en', 03:29:32 INFO - 'LOGNAME': 'cltbld', 03:29:32 INFO - 'MAIL': '/var/mail/cltbld', 03:29:32 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 03:29:32 INFO - 'MOZ_NO_REMOTE': '1', 03:29:32 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 03:29:32 INFO - 'NO_EM_RESTART': '1', 03:29:32 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 03:29:32 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 03:29:32 INFO - 'PWD': '/builds/slave/test', 03:29:32 INFO - 'SHELL': '/bin/bash', 03:29:32 INFO - 'SHLVL': '1', 03:29:32 INFO - 'TERM': 'linux', 03:29:32 INFO - 'TMOUT': '86400', 03:29:32 INFO - 'USER': 'cltbld', 03:29:32 INFO - 'XDG_SESSION_COOKIE': '9c3a94c35cc88655b05d2c08000001b2-1467454824.188659-1286726705', 03:29:32 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 03:29:32 INFO - '_': '/tools/buildbot/bin/python'} 03:29:32 INFO - Ignoring indexes: https://pypi.python.org/simple/ 03:29:32 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 03:29:32 INFO - Cleaning up... 03:29:32 INFO - Return code: 0 03:29:32 INFO - Installing psutil>=3.1.1 into virtualenv /builds/slave/test/build/venv 03:29:32 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 03:29:32 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 03:29:32 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:29:32 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 03:29:32 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 03:29:32 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:29:32 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 0xf00030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10638a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x11c1180>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x11bf3b0>, '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 0x11c02b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x11c0740>, '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': '9c3a94c35cc88655b05d2c08000001b2-1467454824.188659-1286726705', '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 03:29:32 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 03:29:32 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 03:29:32 INFO - Using env: {'DISPLAY': ':0', 03:29:32 INFO - 'HOME': '/home/cltbld', 03:29:32 INFO - 'LANG': 'en_US.UTF-8', 03:29:32 INFO - 'LANGUAGE': 'en_US:en', 03:29:32 INFO - 'LOGNAME': 'cltbld', 03:29:32 INFO - 'MAIL': '/var/mail/cltbld', 03:29:32 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 03:29:32 INFO - 'MOZ_NO_REMOTE': '1', 03:29:32 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 03:29:32 INFO - 'NO_EM_RESTART': '1', 03:29:32 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 03:29:32 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 03:29:32 INFO - 'PWD': '/builds/slave/test', 03:29:32 INFO - 'SHELL': '/bin/bash', 03:29:32 INFO - 'SHLVL': '1', 03:29:32 INFO - 'TERM': 'linux', 03:29:32 INFO - 'TMOUT': '86400', 03:29:32 INFO - 'USER': 'cltbld', 03:29:32 INFO - 'XDG_SESSION_COOKIE': '9c3a94c35cc88655b05d2c08000001b2-1467454824.188659-1286726705', 03:29:32 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 03:29:32 INFO - '_': '/tools/buildbot/bin/python'} 03:29:33 INFO - Ignoring indexes: https://pypi.python.org/simple/ 03:29:33 INFO - Downloading/unpacking psutil>=3.1.1 03:29:33 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 03:29:33 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 03:29:33 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 03:29:33 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 03:29:33 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 03:29:33 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 03:29:35 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 03:29:35 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 03:29:35 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 03:29:35 INFO - Installing collected packages: psutil 03:29:35 INFO - Running setup.py install for psutil 03:29:35 INFO - building 'psutil._psutil_linux' extension 03:29:35 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 03:29:35 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 03:29:35 INFO - building 'psutil._psutil_posix' extension 03:29:35 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 03:29:35 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 03:29:35 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 03:29:35 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 03:29:35 INFO - Successfully installed psutil 03:29:35 INFO - Cleaning up... 03:29:35 INFO - Return code: 0 03:29:35 INFO - Installing mozsystemmonitor==0.3 into virtualenv /builds/slave/test/build/venv 03:29: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')]} 03:29:35 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 03:29:35 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:29: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')]} 03:29:35 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 03:29:35 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:29:35 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 0xf00030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10638a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x11c1180>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x11bf3b0>, '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 0x11c02b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x11c0740>, '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': '9c3a94c35cc88655b05d2c08000001b2-1467454824.188659-1286726705', '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 03:29:35 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 03:29:35 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 03:29:35 INFO - Using env: {'DISPLAY': ':0', 03:29:35 INFO - 'HOME': '/home/cltbld', 03:29:35 INFO - 'LANG': 'en_US.UTF-8', 03:29:35 INFO - 'LANGUAGE': 'en_US:en', 03:29:35 INFO - 'LOGNAME': 'cltbld', 03:29:35 INFO - 'MAIL': '/var/mail/cltbld', 03:29:35 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 03:29:35 INFO - 'MOZ_NO_REMOTE': '1', 03:29:35 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 03:29:35 INFO - 'NO_EM_RESTART': '1', 03:29:35 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 03:29:35 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 03:29:35 INFO - 'PWD': '/builds/slave/test', 03:29:35 INFO - 'SHELL': '/bin/bash', 03:29:35 INFO - 'SHLVL': '1', 03:29:35 INFO - 'TERM': 'linux', 03:29:35 INFO - 'TMOUT': '86400', 03:29:35 INFO - 'USER': 'cltbld', 03:29:35 INFO - 'XDG_SESSION_COOKIE': '9c3a94c35cc88655b05d2c08000001b2-1467454824.188659-1286726705', 03:29:35 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 03:29:35 INFO - '_': '/tools/buildbot/bin/python'} 03:29:35 INFO - Ignoring indexes: https://pypi.python.org/simple/ 03:29:35 INFO - Downloading/unpacking mozsystemmonitor==0.3 03:29:35 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 03:29:35 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 03:29:35 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 03:29:35 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 03:29:35 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 03:29:35 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 03:29:37 INFO - Downloading mozsystemmonitor-0.3.tar.gz 03:29:37 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 03:29:37 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.3) 03:29:37 INFO - Installing collected packages: mozsystemmonitor 03:29:37 INFO - Running setup.py install for mozsystemmonitor 03:29:37 INFO - Successfully installed mozsystemmonitor 03:29:37 INFO - Cleaning up... 03:29:37 INFO - Return code: 0 03:29:37 INFO - Installing jsonschema==2.5.1 into virtualenv /builds/slave/test/build/venv 03:29:37 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 03:29:37 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 03:29:37 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:29:37 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 03:29:37 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 03:29:37 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:29:37 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 0xf00030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10638a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x11c1180>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x11bf3b0>, '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 0x11c02b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x11c0740>, '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': '9c3a94c35cc88655b05d2c08000001b2-1467454824.188659-1286726705', '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 03:29:37 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 03:29:37 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 03:29:37 INFO - Using env: {'DISPLAY': ':0', 03:29:37 INFO - 'HOME': '/home/cltbld', 03:29:37 INFO - 'LANG': 'en_US.UTF-8', 03:29:37 INFO - 'LANGUAGE': 'en_US:en', 03:29:37 INFO - 'LOGNAME': 'cltbld', 03:29:37 INFO - 'MAIL': '/var/mail/cltbld', 03:29:37 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 03:29:37 INFO - 'MOZ_NO_REMOTE': '1', 03:29:37 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 03:29:37 INFO - 'NO_EM_RESTART': '1', 03:29:37 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 03:29:37 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 03:29:37 INFO - 'PWD': '/builds/slave/test', 03:29:37 INFO - 'SHELL': '/bin/bash', 03:29:37 INFO - 'SHLVL': '1', 03:29:37 INFO - 'TERM': 'linux', 03:29:37 INFO - 'TMOUT': '86400', 03:29:37 INFO - 'USER': 'cltbld', 03:29:37 INFO - 'XDG_SESSION_COOKIE': '9c3a94c35cc88655b05d2c08000001b2-1467454824.188659-1286726705', 03:29:37 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 03:29:37 INFO - '_': '/tools/buildbot/bin/python'} 03:29:38 INFO - Ignoring indexes: https://pypi.python.org/simple/ 03:29:38 INFO - Downloading/unpacking jsonschema==2.5.1 03:29:38 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 03:29:38 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 03:29:38 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 03:29:38 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 03:29:38 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 03:29:38 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 03:29:39 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 03:29:40 INFO - Downloading/unpacking functools32 (from jsonschema==2.5.1) 03:29:40 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 03:29:40 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 03:29:40 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 03:29:40 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 03:29:40 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 03:29:40 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 03:29:40 INFO - Downloading functools32-3.2.3-2.tar.gz 03:29:40 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/functools32/setup.py) egg_info for package functools32 03:29:40 INFO - warning: no files found matching '*.txt' 03:29:40 INFO - no previously-included directories found matching 'build' 03:29:40 INFO - no previously-included directories found matching 'dist' 03:29:40 INFO - no previously-included directories found matching '.git*' 03:29:40 INFO - Installing collected packages: jsonschema, functools32 03:29:40 INFO - Running setup.py install for functools32 03:29:40 INFO - warning: no files found matching '*.txt' 03:29:40 INFO - no previously-included directories found matching 'build' 03:29:40 INFO - no previously-included directories found matching 'dist' 03:29:40 INFO - no previously-included directories found matching '.git*' 03:29:40 INFO - Successfully installed jsonschema functools32 03:29:40 INFO - Cleaning up... 03:29:40 INFO - Return code: 0 03:29:40 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 03:29:40 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 03:29:40 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 03:29:40 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:29:40 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 03:29:40 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 03:29:40 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:29:40 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 0xf00030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10638a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x11c1180>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x11bf3b0>, '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 0x11c02b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x11c0740>, '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': '9c3a94c35cc88655b05d2c08000001b2-1467454824.188659-1286726705', '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 03:29:40 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 03:29:40 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 03:29:40 INFO - Using env: {'DISPLAY': ':0', 03:29:40 INFO - 'HOME': '/home/cltbld', 03:29:40 INFO - 'LANG': 'en_US.UTF-8', 03:29:40 INFO - 'LANGUAGE': 'en_US:en', 03:29:40 INFO - 'LOGNAME': 'cltbld', 03:29:40 INFO - 'MAIL': '/var/mail/cltbld', 03:29:40 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 03:29:40 INFO - 'MOZ_NO_REMOTE': '1', 03:29:40 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 03:29:40 INFO - 'NO_EM_RESTART': '1', 03:29:40 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 03:29:40 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 03:29:40 INFO - 'PWD': '/builds/slave/test', 03:29:40 INFO - 'SHELL': '/bin/bash', 03:29:40 INFO - 'SHLVL': '1', 03:29:40 INFO - 'TERM': 'linux', 03:29:40 INFO - 'TMOUT': '86400', 03:29:40 INFO - 'USER': 'cltbld', 03:29:40 INFO - 'XDG_SESSION_COOKIE': '9c3a94c35cc88655b05d2c08000001b2-1467454824.188659-1286726705', 03:29:40 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 03:29:40 INFO - '_': '/tools/buildbot/bin/python'} 03:29:40 INFO - Ignoring indexes: https://pypi.python.org/simple/ 03:29:40 INFO - Downloading/unpacking blobuploader==1.2.4 03:29:40 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 03:29:40 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 03:29:40 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 03:29:40 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 03:29:40 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 03:29:40 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 03:29:42 INFO - Downloading blobuploader-1.2.4.tar.gz 03:29:42 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 03:29:42 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 03:29:42 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 03:29:42 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 03:29:42 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 03:29:42 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 03:29:42 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 03:29:42 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 03:29:42 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 03:29:43 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 03:29:43 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 03:29:43 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 03:29:43 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 03:29:43 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 03:29:43 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 03:29:43 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 03:29:43 INFO - Downloading docopt-0.6.1.tar.gz 03:29:43 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 03:29:43 INFO - Installing collected packages: blobuploader, requests, docopt 03:29:43 INFO - Running setup.py install for blobuploader 03:29:43 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 03:29:43 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 03:29:43 INFO - Running setup.py install for requests 03:29:43 INFO - Running setup.py install for docopt 03:29:43 INFO - Successfully installed blobuploader requests docopt 03:29:43 INFO - Cleaning up... 03:29:43 INFO - Return code: 0 03:29:43 INFO - Installing None into virtualenv /builds/slave/test/build/venv 03:29:43 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 03:29:43 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 03:29:43 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:29:43 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 03:29:43 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 03:29:43 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:29:43 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 0xf00030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10638a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x11c1180>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x11bf3b0>, '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 0x11c02b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x11c0740>, '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': '9c3a94c35cc88655b05d2c08000001b2-1467454824.188659-1286726705', '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 03:29:43 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 03:29:43 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 03:29:43 INFO - Using env: {'DISPLAY': ':0', 03:29:43 INFO - 'HOME': '/home/cltbld', 03:29:43 INFO - 'LANG': 'en_US.UTF-8', 03:29:43 INFO - 'LANGUAGE': 'en_US:en', 03:29:43 INFO - 'LOGNAME': 'cltbld', 03:29:43 INFO - 'MAIL': '/var/mail/cltbld', 03:29:43 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 03:29:43 INFO - 'MOZ_NO_REMOTE': '1', 03:29:43 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 03:29:43 INFO - 'NO_EM_RESTART': '1', 03:29:43 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 03:29:43 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 03:29:43 INFO - 'PWD': '/builds/slave/test', 03:29:43 INFO - 'SHELL': '/bin/bash', 03:29:43 INFO - 'SHLVL': '1', 03:29:43 INFO - 'TERM': 'linux', 03:29:43 INFO - 'TMOUT': '86400', 03:29:43 INFO - 'USER': 'cltbld', 03:29:43 INFO - 'XDG_SESSION_COOKIE': '9c3a94c35cc88655b05d2c08000001b2-1467454824.188659-1286726705', 03:29:43 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 03:29:43 INFO - '_': '/tools/buildbot/bin/python'} 03:29:44 INFO - Ignoring indexes: https://pypi.python.org/simple/ 03:29:44 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 03:29:44 INFO - Running setup.py (path:/tmp/pip-xnAoiZ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 03:29:44 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 03:29:44 INFO - Running setup.py (path:/tmp/pip-cgeChz-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 03:29:44 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 03:29:44 INFO - Running setup.py (path:/tmp/pip-jyaIra-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 03:29:44 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 03:29:44 INFO - Running setup.py (path:/tmp/pip-NgsHyW-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 03:29:44 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 03:29:44 INFO - Running setup.py (path:/tmp/pip-844Fal-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 03:29:44 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 03:29:44 INFO - Running setup.py (path:/tmp/pip-40bDKu-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 03:29:44 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 03:29:44 INFO - Running setup.py (path:/tmp/pip-u5incs-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 03:29:44 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 03:29:44 INFO - Running setup.py (path:/tmp/pip-yJpDCS-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 03:29:44 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 03:29:44 INFO - Running setup.py (path:/tmp/pip-aHIuGd-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 03:29:44 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 03:29:44 INFO - Running setup.py (path:/tmp/pip-nLQMzs-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 03:29:44 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 03:29:44 INFO - Running setup.py (path:/tmp/pip-IxxnLU-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 03:29:44 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 03:29:45 INFO - Running setup.py (path:/tmp/pip-dBZSfb-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 03:29:45 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 03:29:45 INFO - Running setup.py (path:/tmp/pip-fzkpKE-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 03:29:45 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 03:29:45 INFO - Running setup.py (path:/tmp/pip-13VjJR-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 03:29:45 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 03:29:45 INFO - Running setup.py (path:/tmp/pip-p1Zszd-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 03:29:45 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 03:29:45 INFO - Running setup.py (path:/tmp/pip-y973K1-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 03:29:45 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 03:29:45 INFO - Running setup.py (path:/tmp/pip-3ZRLQv-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 03:29:45 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 03:29:45 INFO - Running setup.py install for manifestparser 03:29:45 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 03:29:45 INFO - Running setup.py install for mozcrash 03:29:45 INFO - Running setup.py install for mozdebug 03:29:45 INFO - Running setup.py install for mozdevice 03:29:45 INFO - Installing sutini script to /builds/slave/test/build/venv/bin 03:29:45 INFO - Installing dm script to /builds/slave/test/build/venv/bin 03:29:45 INFO - Running setup.py install for mozfile 03:29:45 INFO - Running setup.py install for mozhttpd 03:29:46 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 03:29:46 INFO - Running setup.py install for mozinfo 03:29:46 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 03:29:46 INFO - Running setup.py install for mozInstall 03:29:46 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 03:29:46 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 03:29:46 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 03:29:46 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 03:29:46 INFO - Running setup.py install for mozleak 03:29:46 INFO - Running setup.py install for mozlog 03:29:46 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 03:29:46 INFO - Running setup.py install for moznetwork 03:29:46 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 03:29:46 INFO - Running setup.py install for mozprocess 03:29:46 INFO - Running setup.py install for mozprofile 03:29:46 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 03:29:46 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 03:29:46 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 03:29:46 INFO - Running setup.py install for mozrunner 03:29:46 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 03:29:46 INFO - Running setup.py install for mozscreenshot 03:29:47 INFO - Running setup.py install for moztest 03:29:47 INFO - Running setup.py install for mozversion 03:29:47 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 03:29:47 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 03:29:47 INFO - Cleaning up... 03:29:47 INFO - Return code: 0 03:29:47 INFO - Installing None into virtualenv /builds/slave/test/build/venv 03:29:47 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 03:29:47 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 03:29:47 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:29:47 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 03:29:47 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 03:29:47 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:29:47 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 0xf00030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10638a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x11c1180>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x11bf3b0>, '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 0x11c02b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x11c0740>, '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': '9c3a94c35cc88655b05d2c08000001b2-1467454824.188659-1286726705', '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 03:29:47 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 03:29:47 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 03:29:47 INFO - Using env: {'DISPLAY': ':0', 03:29:47 INFO - 'HOME': '/home/cltbld', 03:29:47 INFO - 'LANG': 'en_US.UTF-8', 03:29:47 INFO - 'LANGUAGE': 'en_US:en', 03:29:47 INFO - 'LOGNAME': 'cltbld', 03:29:47 INFO - 'MAIL': '/var/mail/cltbld', 03:29:47 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 03:29:47 INFO - 'MOZ_NO_REMOTE': '1', 03:29:47 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 03:29:47 INFO - 'NO_EM_RESTART': '1', 03:29:47 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 03:29:47 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 03:29:47 INFO - 'PWD': '/builds/slave/test', 03:29:47 INFO - 'SHELL': '/bin/bash', 03:29:47 INFO - 'SHLVL': '1', 03:29:47 INFO - 'TERM': 'linux', 03:29:47 INFO - 'TMOUT': '86400', 03:29:47 INFO - 'USER': 'cltbld', 03:29:47 INFO - 'XDG_SESSION_COOKIE': '9c3a94c35cc88655b05d2c08000001b2-1467454824.188659-1286726705', 03:29:47 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 03:29:47 INFO - '_': '/tools/buildbot/bin/python'} 03:29:47 INFO - Ignoring indexes: https://pypi.python.org/simple/ 03:29:47 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 03:29:47 INFO - Running setup.py (path:/tmp/pip-fX2i_H-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 03:29:47 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)) 03:29:47 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 03:29:47 INFO - Running setup.py (path:/tmp/pip-F_BPyw-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 03:29:47 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)) 03:29:47 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 03:29:47 INFO - Running setup.py (path:/tmp/pip-H7Rxpg-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 03:29:47 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)) 03:29:47 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 03:29:47 INFO - Running setup.py (path:/tmp/pip-I_xtQd-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 03:29:47 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)) 03:29:47 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 03:29:47 INFO - Running setup.py (path:/tmp/pip-dUw_sb-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 03:29:47 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)) 03:29:47 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 03:29:47 INFO - Running setup.py (path:/tmp/pip-bszdgB-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 03:29:47 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)) 03:29:47 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 03:29:47 INFO - Running setup.py (path:/tmp/pip-F49Q41-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 03:29:47 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)) 03:29:47 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 03:29:47 INFO - Running setup.py (path:/tmp/pip-cpc9rt-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 03:29:48 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)) 03:29:48 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 03:29:48 INFO - Running setup.py (path:/tmp/pip-9jfu5r-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 03:29:48 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)) 03:29:48 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 03:29:48 INFO - Running setup.py (path:/tmp/pip-MAnrNh-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 03:29:48 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)) 03:29:48 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 03:29:48 INFO - Running setup.py (path:/tmp/pip-fnTPfv-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 03:29:48 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)) 03:29:48 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 03:29:48 INFO - Running setup.py (path:/tmp/pip-H3tE9p-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 03:29:48 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)) 03:29:48 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 03:29:48 INFO - Running setup.py (path:/tmp/pip-IMDaqq-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 03:29:48 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)) 03:29:48 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 03:29:48 INFO - Running setup.py (path:/tmp/pip-pYSRnF-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 03:29:48 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)) 03:29:48 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 03:29:48 INFO - Running setup.py (path:/tmp/pip-xbWuhZ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 03:29:48 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)) 03:29:48 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 03:29:48 INFO - Running setup.py (path:/tmp/pip-sUMbMb-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 03:29:48 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)) 03:29:48 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 03:29:48 INFO - Running setup.py (path:/tmp/pip-tobn4q-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 03:29:48 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)) 03:29:48 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)) 03:29:48 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)) 03:29:48 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)) 03:29:48 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)) 03:29:48 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)) 03:29:48 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.2->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 03:29:48 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 03:29:48 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 03:29:48 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 03:29:48 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 03:29:48 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 03:29:48 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 03:29:50 INFO - Downloading blessings-1.6.tar.gz 03:29:50 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 03:29:50 INFO - Installing collected packages: blessings 03:29:50 INFO - Running setup.py install for blessings 03:29:50 INFO - Successfully installed blessings 03:29:50 INFO - Cleaning up... 03:29:50 INFO - Return code: 0 03:29:50 INFO - Done creating virtualenv /builds/slave/test/build/venv. 03:29:50 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 03:29:50 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 03:29:51 INFO - Reading from file tmpfile_stdout 03:29:51 INFO - Current package versions: 03:29:51 INFO - argparse == 1.2.1 03:29:51 INFO - blessings == 1.6 03:29:51 INFO - blobuploader == 1.2.4 03:29:51 INFO - docopt == 0.6.1 03:29:51 INFO - functools32 == 3.2.3-2 03:29:51 INFO - jsonschema == 2.5.1 03:29:51 INFO - manifestparser == 1.1 03:29:51 INFO - mozInstall == 1.12 03:29:51 INFO - mozcrash == 0.17 03:29:51 INFO - mozdebug == 0.1 03:29:51 INFO - mozdevice == 0.48 03:29:51 INFO - mozfile == 1.2 03:29:51 INFO - mozhttpd == 0.7 03:29:51 INFO - mozinfo == 0.9 03:29:51 INFO - mozleak == 0.1 03:29:51 INFO - mozlog == 3.2 03:29:51 INFO - moznetwork == 0.27 03:29:51 INFO - mozprocess == 0.22 03:29:51 INFO - mozprofile == 0.28 03:29:51 INFO - mozrunner == 6.11 03:29:51 INFO - mozscreenshot == 0.1 03:29:51 INFO - mozsystemmonitor == 0.3 03:29:51 INFO - moztest == 0.7 03:29:51 INFO - mozversion == 1.4 03:29:51 INFO - psutil == 3.1.1 03:29:51 INFO - requests == 1.2.3 03:29:51 INFO - wsgiref == 0.1.2 03:29:51 INFO - Installing None into virtualenv /builds/slave/test/build/venv 03:29:51 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 03:29:51 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 03:29:51 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:29:51 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 03:29:51 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 03:29:51 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:29:51 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 0xf00030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10638a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x11c1180>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x11bf3b0>, '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 0x11c02b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x11c0740>, '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': '9c3a94c35cc88655b05d2c08000001b2-1467454824.188659-1286726705', '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 03:29:51 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 03:29:51 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 03:29:51 INFO - Using env: {'DISPLAY': ':0', 03:29:51 INFO - 'HOME': '/home/cltbld', 03:29:51 INFO - 'LANG': 'en_US.UTF-8', 03:29:51 INFO - 'LANGUAGE': 'en_US:en', 03:29:51 INFO - 'LOGNAME': 'cltbld', 03:29:51 INFO - 'MAIL': '/var/mail/cltbld', 03:29:51 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 03:29:51 INFO - 'MOZ_NO_REMOTE': '1', 03:29:51 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 03:29:51 INFO - 'NO_EM_RESTART': '1', 03:29:51 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 03:29:51 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 03:29:51 INFO - 'PWD': '/builds/slave/test', 03:29:51 INFO - 'SHELL': '/bin/bash', 03:29:51 INFO - 'SHLVL': '1', 03:29:51 INFO - 'TERM': 'linux', 03:29:51 INFO - 'TMOUT': '86400', 03:29:51 INFO - 'USER': 'cltbld', 03:29:51 INFO - 'XDG_SESSION_COOKIE': '9c3a94c35cc88655b05d2c08000001b2-1467454824.188659-1286726705', 03:29:51 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 03:29:51 INFO - '_': '/tools/buildbot/bin/python'} 03:29:51 INFO - Ignoring indexes: https://pypi.python.org/simple/ 03:29:51 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)) 03:29:51 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)) 03:29:51 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)) 03:29:51 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)) 03:29:51 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)) 03:29:51 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)) 03:29:51 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)) 03:29:51 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)) 03:29:51 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)) 03:29:51 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)) 03:29:51 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)) 03:29:51 INFO - Cleaning up... 03:29:51 INFO - Return code: 0 03:29:51 INFO - Installing jsonschema into virtualenv /builds/slave/test/build/venv 03:29:51 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 03:29:51 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 03:29:51 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:29:51 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 03:29:51 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 03:29:51 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 03:29:51 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 0xf00030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x10638a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x11c1180>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x11bf3b0>, '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 0x11c02b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x11c0740>, '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': '9c3a94c35cc88655b05d2c08000001b2-1467454824.188659-1286726705', '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 03:29:51 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 03:29:51 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 03:29:51 INFO - Using env: {'DISPLAY': ':0', 03:29:51 INFO - 'HOME': '/home/cltbld', 03:29:51 INFO - 'LANG': 'en_US.UTF-8', 03:29:51 INFO - 'LANGUAGE': 'en_US:en', 03:29:51 INFO - 'LOGNAME': 'cltbld', 03:29:51 INFO - 'MAIL': '/var/mail/cltbld', 03:29:51 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 03:29:51 INFO - 'MOZ_NO_REMOTE': '1', 03:29:51 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 03:29:51 INFO - 'NO_EM_RESTART': '1', 03:29:51 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 03:29:51 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 03:29:51 INFO - 'PWD': '/builds/slave/test', 03:29:51 INFO - 'SHELL': '/bin/bash', 03:29:51 INFO - 'SHLVL': '1', 03:29:51 INFO - 'TERM': 'linux', 03:29:51 INFO - 'TMOUT': '86400', 03:29:51 INFO - 'USER': 'cltbld', 03:29:51 INFO - 'XDG_SESSION_COOKIE': '9c3a94c35cc88655b05d2c08000001b2-1467454824.188659-1286726705', 03:29:51 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 03:29:51 INFO - '_': '/tools/buildbot/bin/python'} 03:29:51 INFO - Ignoring indexes: https://pypi.python.org/simple/ 03:29:51 INFO - Requirement already satisfied (use --upgrade to upgrade): jsonschema in ./venv/lib/python2.7/site-packages 03:29:51 INFO - Cleaning up... 03:29:51 INFO - Return code: 0 03:29:51 INFO - Running post-action listener: _resource_record_post_action 03:29:51 INFO - Running post-action listener: _start_resource_monitoring 03:29:51 INFO - Starting resource monitoring. 03:29:51 INFO - ##### 03:29:51 INFO - ##### Finished create-virtualenv step (success) 03:29:51 INFO - ##### 03:29:51 INFO - ##### 03:29:51 INFO - ##### Running install step. 03:29:51 INFO - ##### 03:29:51 INFO - Running pre-action listener: _resource_record_pre_action 03:29:51 INFO - Running main action method: install 03:29:51 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 03:29:51 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 03:29:51 INFO - Reading from file tmpfile_stdout 03:29:51 INFO - Detecting whether we're running mozinstall >=1.0... 03:29:51 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 03:29:51 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 03:29:51 INFO - Reading from file tmpfile_stdout 03:29:51 INFO - Output received: 03:29:51 INFO - Usage: mozinstall [options] installer 03:29:51 INFO - Options: 03:29:51 INFO - -h, --help show this help message and exit 03:29:51 INFO - -d DEST, --destination=DEST 03:29:51 INFO - Directory to install application into. [default: 03:29:51 INFO - "/builds/slave/test"] 03:29:51 INFO - --app=APP Application being installed. [default: firefox] 03:29:51 INFO - mkdir: /builds/slave/test/build/application 03:29:51 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'] 03:29:51 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 03:30:08 INFO - Reading from file tmpfile_stdout 03:30:08 INFO - Output received: 03:30:08 INFO - /builds/slave/test/build/application/firefox/firefox 03:30:08 INFO - Running post-action listener: _resource_record_post_action 03:30:08 INFO - ##### 03:30:08 INFO - ##### Finished install step (success) 03:30:08 INFO - ##### 03:30:08 INFO - ##### 03:30:08 INFO - ##### Running run-tests step. 03:30:08 INFO - ##### 03:30:08 INFO - Running pre-action listener: _resource_record_pre_action 03:30:08 INFO - Running main action method: run_tests 03:30:08 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 03:30:08 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 03:30:08 INFO - Python 2.7.3 03:30:08 INFO - Return code: 0 03:30:08 INFO - grabbing minidump binary from tooltool 03:30: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')]} 03:30:08 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 0x11bf3b0>, '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 0x11c02b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x11c0740>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 03:30:08 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 03:30:08 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 03:30:08 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 03:30:08 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 03:30:08 INFO - Return code: 0 03:30:08 INFO - Chmoding /builds/slave/test/build/linux64-minidump_stackwalk to 0755 03:30:08 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 03:30:08 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 03:30:08 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/linux64-minidump_stackwalk 03:30:08 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 03:30:08 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Firefox-Non-PGO', '--suite', 'dromaeojs', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/OP82OBfxQyasCgzP8SZffA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-013', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log'] in /builds/slave/test/build 03:30:08 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/tests/talos/talos/run_tests.py --branchName Firefox-Non-PGO --suite dromaeojs --executablePath /builds/slave/test/build/application/firefox/firefox --symbolsPath https://queue.taskcluster.net/v1/task/OP82OBfxQyasCgzP8SZffA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.crashreporter-symbols.zip --title talos-linux64-ix-013 --webServer localhost --log-tbpl-level=debug --log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log --log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log 03:30:08 INFO - Using env: {'DISPLAY': ':0', 03:30:08 INFO - 'HOME': '/home/cltbld', 03:30:08 INFO - 'LANG': 'en_US.UTF-8', 03:30:08 INFO - 'LANGUAGE': 'en_US:en', 03:30:08 INFO - 'LOGNAME': 'cltbld', 03:30:08 INFO - 'MAIL': '/var/mail/cltbld', 03:30:08 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 03:30:08 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/linux64-minidump_stackwalk', 03:30:08 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 03:30:08 INFO - 'MOZ_NO_REMOTE': '1', 03:30:08 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 03:30:08 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 03:30:08 INFO - 'NO_EM_RESTART': '1', 03:30:08 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 03:30:08 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 03:30:08 INFO - 'PWD': '/builds/slave/test', 03:30:08 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 03:30:08 INFO - 'SHELL': '/bin/bash', 03:30:08 INFO - 'SHLVL': '1', 03:30:08 INFO - 'TERM': 'linux', 03:30:08 INFO - 'TMOUT': '86400', 03:30:08 INFO - 'USER': 'cltbld', 03:30:08 INFO - 'XDG_SESSION_COOKIE': '9c3a94c35cc88655b05d2c08000001b2-1467454824.188659-1286726705', 03:30:08 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 03:30:08 INFO - '_': '/tools/buildbot/bin/python'} 03:30:08 INFO - Calling ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Firefox-Non-PGO', '--suite', 'dromaeojs', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/OP82OBfxQyasCgzP8SZffA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-013', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log'] with output_timeout 3600 03:30:08 INFO - mozversion application_buildid: 20160702021622 03:30:08 INFO - mozversion application_changeset: 39dffbba764210b25bfc1e749b4f16db77fa0d46 03:30:08 INFO - mozversion application_display_name: Nightly 03:30:08 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 03:30:08 INFO - mozversion application_name: Firefox 03:30:08 INFO - mozversion application_remotingname: firefox 03:30:08 INFO - mozversion application_repository: https://hg.mozilla.org/mozilla-central 03:30:08 INFO - mozversion application_vendor: Mozilla 03:30:08 INFO - mozversion application_version: 50.0a1 03:30:08 INFO - mozversion platform_buildid: 20160702021622 03:30:08 INFO - mozversion platform_changeset: 39dffbba764210b25bfc1e749b4f16db77fa0d46 03:30:08 INFO - mozversion platform_repository: https://hg.mozilla.org/mozilla-central 03:30:08 INFO - mozversion platform_version: 50.0a1 03:30:08 INFO - using testdate: 1467455408 03:30:08 INFO - actual date: 1467455408 03:30:08 INFO - starting webserver on 'localhost:57459' 03:30:08 INFO - SUITE-START | Running 2 tests 03:30:08 INFO - TEST-START | dromaeo_css 03:30:08 INFO - operating with platform_type : linux_ 03:30:08 INFO - Initialising browser for dromaeo_css test... 03:30:08 INFO - TEST-INFO | started process 31673 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpIDs04e/profile http://localhost:57459/getInfo.html) 03:30:12 INFO - PROCESS | 31673 | __metrics Screen width/height:1600/1200 03:30:12 INFO - PROCESS | 31673 | colorDepth:24 03:30:12 INFO - PROCESS | 31673 | Browser inner width/height: 1024/697 03:30:12 INFO - PROCESS | 31673 | __metrics 03:30:13 INFO - PROCESS | 31673 | JavaScript error: resource://app/modules/CaptivePortalWatcher.jsm, line 60: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 03:30:14 INFO - TEST-INFO | 31673: exit 0 03:30:14 INFO - Browser initialized. 03:30:14 INFO - Running cycle 1/1 for dromaeo_css test... 03:30:14 INFO - TEST-INFO | started process 31753 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpIDs04e/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 03:30:26 INFO - PROCESS | 31753 | RSS: Main: 159031296 03:30:26 INFO - PROCESS | 31753 | 03:31:17 INFO - PROCESS | 31753 | 1467455477291 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] 03:33:30 INFO - PROCESS | 31753 | Cycle 1(1): loaded http://localhost:57459/tests/dromaeo/cssquery-dojo.html (next: http://localhost:57459/tests/dromaeo/cssquery-ext.html) 03:33:31 INFO - PROCESS | 31753 | RSS: Main: 252301312 03:33:31 INFO - PROCESS | 31753 | 03:36:34 INFO - PROCESS | 31753 | Cycle 1(1): loaded http://localhost:57459/tests/dromaeo/cssquery-ext.html (next: http://localhost:57459/tests/dromaeo/cssquery-jquery.html) 03:36:34 INFO - PROCESS | 31753 | RSS: Main: 252657664 03:36:34 INFO - PROCESS | 31753 | 03:39:36 INFO - PROCESS | 31753 | Cycle 1(1): loaded http://localhost:57459/tests/dromaeo/cssquery-jquery.html (next: http://localhost:57459/tests/dromaeo/cssquery-mootools.html) 03:39:37 INFO - PROCESS | 31753 | RSS: Main: 249024512 03:39:37 INFO - PROCESS | 31753 | 03:42:39 INFO - PROCESS | 31753 | Cycle 1(1): loaded http://localhost:57459/tests/dromaeo/cssquery-mootools.html (next: http://localhost:57459/tests/dromaeo/cssquery-prototype.html) 03:42:40 INFO - PROCESS | 31753 | RSS: Main: 246636544 03:42:40 INFO - PROCESS | 31753 | 03:45:43 INFO - PROCESS | 31753 | Cycle 1(1): loaded http://localhost:57459/tests/dromaeo/cssquery-prototype.html (next: http://localhost:57459/tests/dromaeo/cssquery-yui.html) 03:45:44 INFO - PROCESS | 31753 | RSS: Main: 224264192 03:45:44 INFO - PROCESS | 31753 | 03:48:46 INFO - PROCESS | 31753 | Cycle 1(1): loaded http://localhost:57459/tests/dromaeo/cssquery-yui.html (next: http://localhost:57459/tests/dromaeo/cssquery-dojo.html) 03:48:47 INFO - PROCESS | 31753 | RSS: Main: 281948160 03:48:47 INFO - PROCESS | 31753 | 03:48:47 INFO - PROCESS | 31753 | __start_tp_report 03:48:47 INFO - PROCESS | 31753 | _x_x_mozilla_page_load 03:48:47 INFO - PROCESS | 31753 | _x_x_mozilla_page_load_details 03:48:47 INFO - PROCESS | 31753 | |i|pagename|runs| 03:48:47 INFO - PROCESS | 31753 | |0;dojo.html;2611.777998870096;2644.5107655083807;2673.3183038325224;2680.785537157028;2690.582959641255;4656.790444430008;4705.623550115991;4717.78769955352;4783.043391321737;4835.854924352267;4790;4798.976005119969;4817.470078291385;4862.2463518154655;4866.635002374827;4347.586979236968;4357.586029327209;4432.534583868695;4454.665900057493;4488.506264310923;4413.735175889441;4433.246348120827;4456.665750068758;4458.4204053473;4490.797914093857;4327.156204540101;4370.650347972155;4372.081862808814;4417.624501917341;4435.046465010038;4341.327094300388;4361.716488428242;4366.214081465335;4387.341898715186;4421.823127074913;4396.340548917656;4402.097569998143;4416.249237629579;4446.288593824973;4473.7986790594505;4706.458757242926;4789.544993225638;4848.175810112254;4850.975745121287;4875.171220892421;5248.029114613809;5251.579873610102;5261.0793111205385;5269.920951185735;5274.314339135888;5256.894862102775;5267;5284.5772338212855;5295.4969277918535;5304.389995150568;4679.485256621769;4796.088743138793;4823;4840;4928;5319.601029922771;5326.467353264643;5375.865603359869;5376.78492860289;5378.9462105379225;5068.847934561969;5077.8730531737;5116.360454943132;5119.10415677255;5150.40770311419;5004.399472063303;5096.05722941257;5138.152204886152;5162.5611822994715;5235.685858848405;5127.820526281637;5139.152039913447;5143.922841157386;5149.407818100966;5149.794008239628;5120.590352771769;5122.487751224848;5123.436421993578;5135.897282054413;5167.638265321391;4296.5273819879785;4330.978345108254;4331.220380331508;4382.342648602735;4385.561443855653;3821.426785982125;3860.0735823402742;3877.0695033192396;3878.1855810279594;3880.78655673935;4378.124375124988;4411.117776444724;4431.512533621299;4442.044960333544;4463.509014008457;5152.690838549699;5157;5162.045021671003;5164.715940623302;5206.947930520722;4336.457942757155;4433.379326894237;4434.7560884151035;4445.59989600931;4485.41689580359;4602.355670206174;4634.189016922025;4637.513061128533;4648.48866624671;4650.581447669726;4859.611231101433;4863.10032643962;4865.5864251539015;4868.853934381974;4910.48439913811;4987.401511818605;5155.149400348901;5176.145935920531;5182.041322355376;5233.869153271199;4850.80596776125;4899.804007839789;4906.779194936165;4916.557509824133;4960.826371076995;5117.078925793393;5130;5140.614453916046;5140.691558506352;5197.0125676121415;5062.594992400525;5184.144616138295;5201.687898726089;5215.217717342429;5234.450382709913;5069.290299358019;5081.9745901271735;5083.542481176712;5086.694798312114;5125.2568377585785;5083.440821509705;5086.974565127299;5088.465711100281;5089.7709603067215;5122.923156152735;4848.442429120555;4872.317875497362;4918.286848407032;4924.8276310328965;4998.6750861193905;5013.699178049329;5015.623828212972;5017;5027.899442011212;5066.974665126798;4933.038057578881;4935.432425271139;4936.679115857458;4938.604911607134;4992.675476094042 03:48:47 INFO - PROCESS | 31753 | |1;ext.html;565.1466285908277;567.2880534928664;575.4331982996745;579.2556564814215;589.0957380421053;27798.44403111939;30351.08946731596;30423;39866;41479.58520414795;41409;41954;41970.37044444328;42036;42077.36883946736;7839.804004899866;7994.960025199865;7995.800104997364;7996.280334769869;8002.399820013522;7575.583342916138;7748.41886858485;7749.0701115865895;7892.329152022085;7995.200479951987;10207.642732504364;10467.685969420929;10468.790624187512;10807.135429165688;10820.837687434694;10336.224783141257;10429;10434.843477347846;10435.217358698052;10440.738981525446;7560.168381478033;9880.11079002886;10203.795924081476;10295;10298.79402411955;38845.61154388476;39224.215515689524;39240.21519569621;39242;39316.80341598302;2185.4645611825044;2760.8611422951217;2840;2919.2847752300822;3295.8516866741056;27339.726602734117;30052.24869378261;30363.392732145232;30549.847250763825;31450;3426.417509023472;3444.7801443232092;3471.097514646185;3484.372812893678;3524.8766293179615;266990;267272;268255;268884;269428;56036.719816400655;56135.43864561302;56397.71801140968;56444.71777641086;56471.435285647436;49740.75129624329;55939.72030139823;57092;57266.141007884915;64675.35324646787;15034.323455444532;15096.320665570076;15108.697826043637;15192.544223673307;15195.392184312504;11618.6514404568;11693.473793679304;11706.531738730355;11709.414529273503;11709.941450292694;15156.621084472756;15480.303386347641;15489.84510154884;16034.518964431085;17098.572535686457;5786.421357864264;5963.970180149158;6059.848628760521;6062.575619706667;6137.110119032715;799.9840003199903;866.644675682967;943.7027336389016;954.3319676226669;1003.9096481316717;28562.571561426594;28666.713332866406;28724.42551149007;29048.85475572651;29351.85324073366;980.4901451245313;983.9324333098525;998.2612866478898;1000.4847503535685;1019.5513973851481;14922.925385373004;15472.458463953708;15487.225638718019;15689.372425103096;15723.135227562365;371454;373239;373890;374530;375101;50323;50329.24506132411;50384.74807626012;50394.748026260364;50398.49601503938;1127.6166103524677;1153.8096214124575;1193.0396031194798;1196.4496331687346;1216.2702378572785;27147.457050859266;28435;28453.146405607866;28477.430451390443;28904.710952891044;44771.07518173064;45181;45235.773821130686;45241;45279;325544;327319;327420;327852;328799;36818.26363472769;38749.225015500095;39189.216215674955;39229;39497.21005579815;41103.38344924769;43471;43487.347689784045;44241.55758442375;44495.777521112184;37484.625153748115;37772.24455510819;37890.2421951565;38079.80960095182;38135.237295253384;36131.277374451834;37250.44124338083;37864.62135378611;38044.61955380521;38250.426243606926;36429.81785091163;36933.076673082316;37200.25599488049;37440.812795935846;37605.2478950414;31541.053768386984;33054;33561;33948.66051339455;34012.82993585016;24981.87509062443;25333.87333063323;25551.744482554936;26093.869530652224;26376.20871373862 03:48:47 INFO - PROCESS | 31753 | |2;jquery.html;354.62055600507466;363.9144800971772;364.51883513761834;369.5620689482963;394.6842525979216;13075.280859552733;16219.83780162198;17029.23368448418;17715.379961701343;18575.164117614706;16819;16946.661066778688;17229.913850430763;17469;17806.82193178068;5026.673266237701;5222.981518603874;5265.0259701955065;5271.077561426735;5387.703676297802;3704.46285288633;5287.259783630295;5877.941220587803;6191.752329906798;6226.719797609096;6190.907136392958;6258.843528911791;6271.184745983016;6286.245650521921;6292.056191571278;6091.238595175603;6263.185785847811;6265.279492858334;6266.749330026793;6268.435840774307;3355.7818741781707;5120.308758317617;5416.51251387377;5432.158015507603;5472.835814925519;21897.671534926987;21997;22234.444138896495;22244.666330005064;22305.665415018786;1836.6785812482763;1872.3914727713411;1914.6840771272723;1931.2950772967906;1939.8836069835713;13289.136206146666;13761;13838.23889686077;14002;14340.713185736227;1752.1589636974325;1821.3989383503413;1832.752578401912;1859.4142845003917;1866.850651947841;70411;72469.6376518114;74147.62926185389;74891.62554187249;75316;8368;8860.64557417696;9388.765280867896;9711.514424278757;9895.505224738878;12405.503779848885;13174.868251317555;13263.204207747565;13524.59426217215;13633.454661813417;7255.492115551966;7487.8502429951095;7495.437842161859;7652.311291983749;7784.065912090586;7374.930635057886;7420.814479637944;7502;7522.736704215326;7539.283768042027;6010.188624535632;6186.907196392058;6203.193584834033;6238.688065596702;6322.557420980487;1730.70197351986;1731.1603872122012;1745.1099939030933;1785.2501949181114;1795.2998330651058;829.6764261937849;857.1000449528095;871.8822958900594;873.2969959182792;881.7178502879017;17743.290268389377;17805.554861128316;18128.637427251644;18139.54651133732;18489.795108792467;828.883956246126;836.6611522333465;837.7810286033806;843.6709683223547;895.0333639669142;9886.357386769838;10103.949480252699;10306.742331441625;10314.27800053989;10390.948045259876;403483;404458;410486;411978;412241;71030.28969710237;71462;72972;73416.29128941384;74463.62768186124;874.191372979991;881.2553392383426;881.6341218394294;886.0519244408421;895.6283142495791;14644.065086954099;15808.209589520708;15966.28151733198;16169.434069807501;16426.096564688578;23863.227937248448;29627.40745185041;36248.27503449969;36369.81815090908;36581;45170.870728232054;45487.09025819399;45668;45786.54213457823;46064;7491.688954432843;7610.12483564375;7649.502782319131;7680.423968202295;7846.882296765667;11702.531898723955;12185.147039707135;12208.450619721956;12280.201786883825;12449.75100497967;10309.74225644365;10318.277720559488;10335.741606459598;10382.740431488972;10530.526126324181;10594.947025264824;10636.52135653882;10774.730631733955;10827.242093053726;10863.348199108079;10420.68737937863;10571.788564228826;10753.838692419777;10811.35131892089;11016.1187105033;7445.813854653677;7529.736459223901;7559.055118110236;7601.923980760122;7635.732749353968;10514.789704206027;10667.306625069656;10706.518206680874;10733.516991735547;10736.570537178737 03:48:47 INFO - PROCESS | 31753 | |3;mootools.html;1376.3393571085878;1398.2798858587828;1456.3155317001012;1676.4802911097568;1680.15992003998;7526.661300241489;7929.881051784228;8039.79900502487;8077.596120193996;8079.717209897654;6964.233934267227;7435.516691415054;7657.3874090072795;7695.653695583698;7911.327537159334;2267.9319620411416;2297.058206135485;2299.2067736630834;2300.1834348806183;2303.1248125712204;2217.39021769014;2254.966175507369;2298.436882963668;2301.6432452969734;2310.676505289261;1940.2433051110079;2188.8139508141826;2255.6616507523922;2259.2996171186983;2263.6265016272296;2292.7248730152323;2298.310506847939;2317.7450480447137;2331.3239160643393;2331.895064722083;2263.3323169664823;2282.3837563857664;2286.1312701173615;2286.748457669655;2287.176616418088;8063.27430531255;8111.837763244761;8121.147279535623;8127.187281271885;8130.430869839054;4663.27719203524;4751.904961900743;4787.473377928425;4793.089313030513;4794.256890182028;2847.5870998705072;2947.7199666031693;2972.1232236490287;2986.656534498539;2997.640283166012;934.8831396075491;945.5366870233605;952.3429233134297;959.9280053995979;960.1454705312277;10869.347839129678;10870.347779133277;10879.564817407374;10888.074513666348;10890.945545272223;4316.244657185043;4420.336949457543;4436.622887054572;4637.188492013884;4653.95346046542;8544.444611100258;8558.743237702878;8628.094050124771;8628.827423451496;8631.093735157718;4705.458872229738;4739.241721324572;4742.146413645508;4743.288506724019;4745.83389581363;4295.8496452624;4406.669499787465;4409.603135717801;4412.646988240933;4441.111777644484;3410.710089642408;3417.094469965461;3458.8097654629237;3480.3735327641266;3507.5440192774777;990.222675199979;1017.6692574913183;1038.8182068138046;1064.8402739589123;1067.3649178738638;786.217713375184;858.5315326082557;859.7850537365658;892.7991201979503;904.0778406025817;5257.132573125468;5394.838154855361;5414.566834653218;5579.107342825209;5611.242482264924;831.3141658132065;844.8817165596821;854.1415877043655;891.9598618062203;903.584351198443;3654.775650157227;3838.1172330364175;3844.8077596120083;3880.165764360676;4058.6347228749555;9828.901710982942;9940.254480913816;9946.850797238047;10063.748406289755;10098.545565449573;9000.50497222646;9025.503597302211;9853.704388868346;10005.54975026111;10027.598896044223;7200.603966781878;7421.703131874772;7597.050368703912;7611.809704757315;7613.771586852404;5430.131179011497;5497.120460726264;5516.117421212587;5571.749271282721;5688.089905615082;8636.17956294151;8921.955390223007;8935.553222338727;9110.635574576943;9162.954185229031;8749.650013999624;9126.224270937044;9133;9236.168744813;9265.490398027903;7645.694172233048;7700.884486732815;7716.112647045662;7732.342750866239;7808.609569521387;7743.2643898831775;7747.651355688895;7792.064952205772;7807.453478256694;7811.257930496594;6908.171019477695;6917.204521480095;7148.392386647193;7149.320814522612;7265.382442492236;6885.483588730765;6887.381465355537;6920.411765000032;6972.965135174494;7058.505904586835;6526.412622863965;6601.768938087144;6647.7008534617025;6655.168103987002;6656.633885136364;4807.533702220856;4816.373871396696;4820.1805693031565;4827.686200396963;4875.536824001714;4725.8582242532775;4786.521347865186;4815.30178124163;4822.228443449031;4832.106060378841 03:48:47 INFO - PROCESS | 31753 | |4;prototype.html;287.649068136873;295.6880491081908;297.2894781472282;307.0297858766299;308.71289700578467;4665.370175026371;4807;4882.8779280518;4942.159832828419;4950.826721064764;4696.765161741908;4816.217999340241;4828.613710903128;4833.4924832892475;4835.661503694742;3829.5404551453867;3846.288436639217;3853.344931361675;3864.1692036212207;3872.67082298005;3657.6159503252175;3727.1986522897573;3848.942265866014;3878.9030274243087;3885.164689591737;3820.0640842993507;3824.6749026332654;3830.9616903830884;3834.731568790186;3835.7506762060375;3810.6951443884423;3813.961860381416;3839.0037180666036;3844.2119365529998;3863.864764733249;3386.72906167506;3387.915302117442;3404.438267685829;3408.812515311657;3414.897553073412;4581.541845815425;4707.529247075299;4731.195696731564;4741.122892264942;4750.8337208197545;4360.781960901974;4362.563743625612;4369;4373.825046998148;4390.914315700049;5035.093683137034;5039.118154322979;5060.544550990428;5093.236014597803;5128.820371314619;3611.368010598161;3730.9067273318115;3736.682381997506;3738.6635202831603;3742.0457783265365;5266.183741520071;5268.3404727510715;5272.393674727417;5297.735113244361;5300.2314664373835;3786.469894214812;3795.5065841440987;3799.4870692456166;3805.4862593549515;3826.3686491728554;3784.924301513954;3867.671247943956;3883.786391748481;3887.8639247626197;3893.5717071122153;4298.871033868989;4306.332518459643;4330.133973205371;4339.609435150788;4361.498427680794;4993.925091123636;5016.899662006813;5024.49755024502;5057.848264552069;5084.8220312288895;1251.6432816647393;1289.7936330187124;1327.4756471193825;1332.160738734591;1335.30564106664;902.4495058014605;911.8541033434618;928.1600151862575;933.0855761353911;937.7655586103474;4447.710898791568;4449.57729015743;4465.464144302639;4471.7987690554;4489.708168969007;5124.641275110781;5134.589232861362;5135.79308862417;5146.974265128651;5148.922766158511;4336.251804274315;4441.311596702516;4447.666425018072;4463.35281384204;4481.148581769454;2376.7623237676094;2461.289403864297;2472.6909136357954;2475.9752402476106;2482.255323402972;4324.56754324565;4377.233984052778;4392.890177745518;4405.185040767468;4417.558244175621;4728.1252968201;4751.239801631722;4755.48094410134;4756.524347565216;4765.237561990065;4197.622214000755;4286.885409793414;4352.956470435319;4377.97117677352;4383.408239887638;4591.632669386508;4628.143793398098;4629.213033784332;4640.675152739276;4651.209294419889;4529.365888775508;4555.293929440942;4557.680962332605;4565.3836732040745;4583.335416364675;4095;4335.653147748236;4374.1907747065625;4387.802548885372;4417.094495628453;3421.886083663854;3439.570053743282;3449.8098156136093;3479.7216222702627;3481.7736847104857;4653.906921861476;4655.441347038377;4667.719936803803;4698.882527936829;5044.192929131322;4879.243717223836;5051.368578927634;5057.266696329085;5074.213496907985;5087.4149472811105;5055.977608956447;5095.515925987025;5098.388193416814;5100.724818795301;5110.160342276703;4876.21980483121;5009.373828271466;5048.570871475818;5062.215356619583;5080.796768129233;5119.308893299357;5123.666961647481;5123.897522049613;5125.077486052546;5135.2553879687985;4998.6750861193905;5014.899702006012;5037.496250375079;5038.697678139323;5069.9746501267255 03:48:47 INFO - PROCESS | 31753 | |5;yui.html;659.7591878964176;663.2273401487267;670.5942904542754;705.7247673407369;757.4849102610225;12555.560555380564;13973.301334933238;13978.510752123677;13987.860121398782;13990.650233744162;12401.689957751061;12547.247165170073;12699.873001269985;13129.343532823368;13233.338333083355;779.3531368963746;785.8978332816725;792.9484583502054;794.8608993426157;795.7891158842912;628.4406877878691;767.1369709077288;793.6309616028545;797.3581267079999;799.8440304140695;820.3847114664002;820.7619790260848;823.9423240373176;824.0770337222319;824.2416976381713;650.3204151661478;814.7840822182097;818.7830224990382;821.8726097454934;822.9917700823005;584;603.5714642603757;605.315992927993;606.4329851588778;607.7265230646227;12950.028747843855;13005.869941300654;13013.869861301455;13024.153430027112;13089.083764136514;11361.318320900773;11566.190366674336;11994.100442466763;12296.754064918741;12578.245305281622;10586.258961872594;10647.201459890539;10729.9463502682;10751.086157676607;10792.244542882001;4001.799910004488;4004.979975100135;4084.7140700151003;4088.8773336799945;4168.91662166758;56094.15858762122;57012.714936425466;57526;57801.71099144477;58311.70844145752;9788.608455661693;10050.346727462691;10128.088472037552;10139.138173255356;10273.332233404954;19432.2227110914;20886.895565522074;20977.89511052435;20985.055672494775;21022.78977210208;7228.277172282729;7300.525465844703;7358.742444014434;7407.185209626937;7429.591372474458;3802.1825307559006;3857.4213867920034;3880.611938806097;3952.980235098806;4006.2788698034633;2922.4885645012464;3023.7580993520464;3024.380002099564;3025.8638361273797;3026.2585666511404;520.0690763533308;522.4462070205518;529.1190168369699;529.6768970927731;539.5440852479649;505.3455774771679;535.9517643412033;567.140781715701;581.4970050905936;586.9090291004901;8412.747617571482;8415.663373465115;8642.956785216034;8802.251808596213;8804.691835785845;577.8295402856168;579.4090028171325;598.4464370457309;603.809799913026;612.3784358875745;4328.177646247203;4570.360149579062;4729.7398643074275;4901.705897646153;4934.407871055496;77096;80049.59975200087;80113;87100;102029.48985255026;77181.61409192918;79057.60471197608;79082;79409.60295198487;79654.42419030728;69887.65056174686;71406.64296678483;71966.64016679987;72121.6393918027;72875.63562182155;8842.115788421106;8973.955130224569;9093.454392736458;9320.906790932004;9345.392549484262;41661.166776664904;41984.58015419807;42284.57715422806;42390;42861.571384287;57071;61263.38736612755;62073.37926620676;62638.373616263256;64244.67877660582;11318.94340528292;11597.246178998676;11688;11846.11154163424;12240.265584064984;12718.491260349852;12734.299613521345;12928.288944108164;13600.310500283804;13749.381277842322;12105.818412723993;12350;12633.494660213857;12753.501568463143;13118.803217951929;12257.938710306391;12398.5660501882;12442.315672638091;12568.245905245714;13009.674758131123;12247.571335003233;12855.228686278853;12914;13049.869501304865;13171.60485185446;9567.952160239154;9868.210543156387;10199.694009179737;10246.487675616338;10433.478326083514;10220;10429.947850261004;10550.736231594272;10576.576936922746;10693.679189624323 03:48:47 INFO - PROCESS | 31753 | __end_tp_report 03:48:47 INFO - PROCESS | 31753 | __start_cc_report 03:48:47 INFO - PROCESS | 31753 | _x_x_mozilla_cycle_collect,980 03:48:47 INFO - PROCESS | 31753 | __end_cc_report 03:48:47 INFO - PROCESS | 31753 | __startTimestamp1467456527165__endTimestamp 03:48:47 INFO - PROCESS | 31753 | 03:48:47 INFO - PROCESS | 31753 | ------- Summary: start ------- 03:48:47 INFO - PROCESS | 31753 | Number of tests: 6 03:48:47 INFO - PROCESS | 31753 | 03:48:47 INFO - PROCESS | 31753 | [#0] dojo.html Cycles:165 Average:4772.87 Median:4906.78 stddev:516.22 (10.5%) stddev-sans-first:489.17 03:48:47 INFO - PROCESS | 31753 | Values: 2611.8 2644.5 2673.3 2680.8 2690.6 4656.8 4705.6 4717.8 4783.0 4835.9 4790.0 4799.0 4817.5 4862.2 4866.6 4347.6 4357.6 4432.5 4454.7 4488.5 4413.7 4433.2 4456.7 4458.4 4490.8 4327.2 4370.7 4372.1 4417.6 4435.0 4341.3 4361.7 4366.2 4387.3 4421.8 4396.3 4402.1 4416.2 4446.3 4473.8 4706.5 4789.5 4848.2 4851.0 4875.2 5248.0 5251.6 5261.1 5269.9 5274.3 5256.9 5267.0 5284.6 5295.5 5304.4 4679.5 4796.1 4823.0 4840.0 4928.0 5319.6 5326.5 5375.9 5376.8 5378.9 5068.8 5077.9 5116.4 5119.1 5150.4 5004.4 5096.1 5138.2 5162.6 5235.7 5127.8 5139.2 5143.9 5149.4 5149.8 5120.6 5122.5 5123.4 5135.9 5167.6 4296.5 4331.0 4331.2 4382.3 4385.6 3821.4 3860.1 3877.1 3878.2 3880.8 4378.1 4411.1 4431.5 4442.0 4463.5 5152.7 5157.0 5162.0 5164.7 5206.9 4336.5 4433.4 4434.8 4445.6 4485.4 4602.4 4634.2 4637.5 4648.5 4650.6 4859.6 4863.1 4865.6 4868.9 4910.5 4987.4 5155.1 5176.1 5182.0 5233.9 4850.8 4899.8 4906.8 4916.6 4960.8 5117.1 5130.0 5140.6 5140.7 5197.0 5062.6 5184.1 5201.7 5215.2 5234.5 5069.3 5082.0 5083.5 5086.7 5125.3 5083.4 5087.0 5088.5 5089.8 5122.9 4848.4 4872.3 4918.3 4924.8 4998.7 5013.7 5015.6 5017.0 5027.9 5067.0 4933.0 4935.4 4936.7 4938.6 4992.7 03:48:47 INFO - PROCESS | 31753 | 03:48:47 INFO - PROCESS | 31753 | [#1] ext.html Cycles:180 Average:48721.67 Median:36624.04 stddev:85545.50 (233.6%) stddev-sans-first:85709.07 03:48:47 INFO - PROCESS | 31753 | Values: 565.1 567.3 575.4 579.3 589.1 27798.4 30351.1 30423.0 39866.0 41479.6 41409.0 41954.0 41970.4 42036.0 42077.4 7839.8 7995.0 7995.8 7996.3 8002.4 7575.6 7748.4 7749.1 7892.3 7995.2 10207.6 10467.7 10468.8 10807.1 10820.8 10336.2 10429.0 10434.8 10435.2 10440.7 7560.2 9880.1 10203.8 10295.0 10298.8 38845.6 39224.2 39240.2 39242.0 39316.8 2185.5 2760.9 2840.0 2919.3 3295.9 27339.7 30052.2 30363.4 30549.8 31450.0 3426.4 3444.8 3471.1 3484.4 3524.9 266990.0 267272.0 268255.0 268884.0 269428.0 56036.7 56135.4 56397.7 56444.7 56471.4 49740.8 55939.7 57092.0 57266.1 64675.4 15034.3 15096.3 15108.7 15192.5 15195.4 11618.7 11693.5 11706.5 11709.4 11709.9 15156.6 15480.3 15489.8 16034.5 17098.6 5786.4 5964.0 6059.8 6062.6 6137.1 800.0 866.6 943.7 954.3 1003.9 28562.6 28666.7 28724.4 29048.9 29351.9 980.5 983.9 998.3 1000.5 1019.6 14922.9 15472.5 15487.2 15689.4 15723.1 371454.0 373239.0 373890.0 374530.0 375101.0 50323.0 50329.2 50384.7 50394.7 50398.5 1127.6 1153.8 1193.0 1196.4 1216.3 27147.5 28435.0 28453.1 28477.4 28904.7 44771.1 45181.0 45235.8 45241.0 45279.0 325544.0 327319.0 327420.0 327852.0 328799.0 36818.3 38749.2 39189.2 39229.0 39497.2 41103.4 43471.0 43487.3 44241.6 44495.8 37484.6 37772.2 37890.2 38079.8 38135.2 36131.3 37250.4 37864.6 38044.6 38250.4 36429.8 36933.1 37200.3 37440.8 37605.2 31541.1 33054.0 33561.0 33948.7 34012.8 24981.9 25333.9 25551.7 26093.9 26376.2 03:48:47 INFO - PROCESS | 31753 | 03:48:47 INFO - PROCESS | 31753 | [#2] jquery.html Cycles:180 Average:24909.82 Median:201938.84 stddev:67197.88 (33.3%) stddev-sans-first:67361.09 03:48:47 INFO - PROCESS | 31753 | Values: 354.6 363.9 364.5 369.6 394.7 13075.3 16219.8 17029.2 17715.4 18575.2 16819.0 16946.7 17229.9 17469.0 17806.8 5026.7 5223.0 5265.0 5271.1 5387.7 3704.5 5287.3 5877.9 6191.8 6226.7 6190.9 6258.8 6271.2 6286.2 6292.1 6091.2 6263.2 6265.3 6266.7 6268.4 3355.8 5120.3 5416.5 5432.2 5472.8 21897.7 21997.0 22234.4 22244.7 22305.7 1836.7 1872.4 1914.7 1931.3 1939.9 13289.1 13761.0 13838.2 14002.0 14340.7 1752.2 1821.4 1832.8 1859.4 1866.9 70411.0 72469.6 74147.6 74891.6 75316.0 8368.0 8860.6 9388.8 9711.5 9895.5 12405.5 13174.9 13263.2 13524.6 13633.5 7255.5 7487.9 7495.4 7652.3 7784.1 7374.9 7420.8 7502.0 7522.7 7539.3 6010.2 6186.9 6203.2 6238.7 6322.6 1730.7 1731.2 1745.1 1785.3 1795.3 829.7 857.1 871.9 873.3 881.7 17743.3 17805.6 18128.6 18139.5 18489.8 828.9 836.7 837.8 843.7 895.0 9886.4 10103.9 10306.7 10314.3 10390.9 403483.0 404458.0 410486.0 411978.0 412241.0 71030.3 71462.0 72972.0 73416.3 74463.6 874.2 881.3 881.6 886.1 895.6 14644.1 15808.2 15966.3 16169.4 16426.1 23863.2 29627.4 36248.3 36369.8 36581.0 45170.9 45487.1 45668.0 45786.5 46064.0 7491.7 7610.1 7649.5 7680.4 7846.9 11702.5 12185.1 12208.5 12280.2 12449.8 10309.7 10318.3 10335.7 10382.7 10530.5 10594.9 10636.5 10774.7 10827.2 10863.3 10420.7 10571.8 10753.8 10811.4 11016.1 7445.8 7529.7 7559.1 7601.9 7635.7 10514.8 10667.3 10706.5 10733.5 10736.6 03:48:47 INFO - PROCESS | 31753 | 03:48:47 INFO - PROCESS | 31753 | [#3] mootools.html Cycles:180 Average:5281.40 Median:5422.35 stddev:2919.79 (53.8%) stddev-sans-first:2913.24 03:48:47 INFO - PROCESS | 31753 | Values: 1376.3 1398.3 1456.3 1676.5 1680.2 7526.7 7929.9 8039.8 8077.6 8079.7 6964.2 7435.5 7657.4 7695.7 7911.3 2267.9 2297.1 2299.2 2300.2 2303.1 2217.4 2255.0 2298.4 2301.6 2310.7 1940.2 2188.8 2255.7 2259.3 2263.6 2292.7 2298.3 2317.7 2331.3 2331.9 2263.3 2282.4 2286.1 2286.7 2287.2 8063.3 8111.8 8121.1 8127.2 8130.4 4663.3 4751.9 4787.5 4793.1 4794.3 2847.6 2947.7 2972.1 2986.7 2997.6 934.9 945.5 952.3 959.9 960.1 10869.3 10870.3 10879.6 10888.1 10890.9 4316.2 4420.3 4436.6 4637.2 4654.0 8544.4 8558.7 8628.1 8628.8 8631.1 4705.5 4739.2 4742.1 4743.3 4745.8 4295.8 4406.7 4409.6 4412.6 4441.1 3410.7 3417.1 3458.8 3480.4 3507.5 990.2 1017.7 1038.8 1064.8 1067.4 786.2 858.5 859.8 892.8 904.1 5257.1 5394.8 5414.6 5579.1 5611.2 831.3 844.9 854.1 892.0 903.6 3654.8 3838.1 3844.8 3880.2 4058.6 9828.9 9940.3 9946.9 10063.7 10098.5 9000.5 9025.5 9853.7 10005.5 10027.6 7200.6 7421.7 7597.1 7611.8 7613.8 5430.1 5497.1 5516.1 5571.7 5688.1 8636.2 8922.0 8935.6 9110.6 9163.0 8749.7 9126.2 9133.0 9236.2 9265.5 7645.7 7700.9 7716.1 7732.3 7808.6 7743.3 7747.7 7792.1 7807.5 7811.3 6908.2 6917.2 7148.4 7149.3 7265.4 6885.5 6887.4 6920.4 6973.0 7058.5 6526.4 6601.8 6647.7 6655.2 6656.6 4807.5 4816.4 4820.2 4827.7 4875.5 4725.9 4786.5 4815.3 4822.2 4832.1 03:48:47 INFO - PROCESS | 31753 | 03:48:47 INFO - PROCESS | 31753 | [#4] prototype.html Cycles:180 Average:4111.45 Median:4464.41 stddev:1167.89 (26.2%) stddev-sans-first:1135.35 03:48:47 INFO - PROCESS | 31753 | Values: 287.6 295.7 297.3 307.0 308.7 4665.4 4807.0 4882.9 4942.2 4950.8 4696.8 4816.2 4828.6 4833.5 4835.7 3829.5 3846.3 3853.3 3864.2 3872.7 3657.6 3727.2 3848.9 3878.9 3885.2 3820.1 3824.7 3831.0 3834.7 3835.8 3810.7 3814.0 3839.0 3844.2 3863.9 3386.7 3387.9 3404.4 3408.8 3414.9 4581.5 4707.5 4731.2 4741.1 4750.8 4360.8 4362.6 4369.0 4373.8 4390.9 5035.1 5039.1 5060.5 5093.2 5128.8 3611.4 3730.9 3736.7 3738.7 3742.0 5266.2 5268.3 5272.4 5297.7 5300.2 3786.5 3795.5 3799.5 3805.5 3826.4 3784.9 3867.7 3883.8 3887.9 3893.6 4298.9 4306.3 4330.1 4339.6 4361.5 4993.9 5016.9 5024.5 5057.8 5084.8 1251.6 1289.8 1327.5 1332.2 1335.3 902.4 911.9 928.2 933.1 937.8 4447.7 4449.6 4465.5 4471.8 4489.7 5124.6 5134.6 5135.8 5147.0 5148.9 4336.3 4441.3 4447.7 4463.4 4481.1 2376.8 2461.3 2472.7 2476.0 2482.3 4324.6 4377.2 4392.9 4405.2 4417.6 4728.1 4751.2 4755.5 4756.5 4765.2 4197.6 4286.9 4353.0 4378.0 4383.4 4591.6 4628.1 4629.2 4640.7 4651.2 4529.4 4555.3 4557.7 4565.4 4583.3 4095.0 4335.7 4374.2 4387.8 4417.1 3421.9 3439.6 3449.8 3479.7 3481.8 4653.9 4655.4 4667.7 4698.9 5044.2 4879.2 5051.4 5057.3 5074.2 5087.4 5056.0 5095.5 5098.4 5100.7 5110.2 4876.2 5009.4 5048.6 5062.2 5080.8 5119.3 5123.7 5123.9 5125.1 5135.3 4998.7 5014.9 5037.5 5038.7 5070.0 03:48:47 INFO - PROCESS | 31753 | 03:48:47 INFO - PROCESS | 31753 | [#5] yui.html Cycles:180 Average:17223.60 Median:4815.72 stddev:23325.14 (484.4%) stddev-sans-first:23357.41 03:48:47 INFO - PROCESS | 31753 | Values: 659.8 663.2 670.6 705.7 757.5 12555.6 13973.3 13978.5 13987.9 13990.7 12401.7 12547.2 12699.9 13129.3 13233.3 779.4 785.9 792.9 794.9 795.8 628.4 767.1 793.6 797.4 799.8 820.4 820.8 823.9 824.1 824.2 650.3 814.8 818.8 821.9 823.0 584.0 603.6 605.3 606.4 607.7 12950.0 13005.9 13013.9 13024.2 13089.1 11361.3 11566.2 11994.1 12296.8 12578.2 10586.3 10647.2 10729.9 10751.1 10792.2 4001.8 4005.0 4084.7 4088.9 4168.9 56094.2 57012.7 57526.0 57801.7 58311.7 9788.6 10050.3 10128.1 10139.1 10273.3 19432.2 20886.9 20977.9 20985.1 21022.8 7228.3 7300.5 7358.7 7407.2 7429.6 3802.2 3857.4 3880.6 3953.0 4006.3 2922.5 3023.8 3024.4 3025.9 3026.3 520.1 522.4 529.1 529.7 539.5 505.3 536.0 567.1 581.5 586.9 8412.7 8415.7 8643.0 8802.3 8804.7 577.8 579.4 598.4 603.8 612.4 4328.2 4570.4 4729.7 4901.7 4934.4 77096.0 80049.6 80113.0 87100.0 102029.5 77181.6 79057.6 79082.0 79409.6 79654.4 69887.7 71406.6 71966.6 72121.6 72875.6 8842.1 8974.0 9093.5 9320.9 9345.4 41661.2 41984.6 42284.6 42390.0 42861.6 57071.0 61263.4 62073.4 62638.4 64244.7 11318.9 11597.2 11688.0 11846.1 12240.3 12718.5 12734.3 12928.3 13600.3 13749.4 12105.8 12350.0 12633.5 12753.5 13118.8 12257.9 12398.6 12442.3 12568.2 13009.7 12247.6 12855.2 12914.0 13049.9 13171.6 9568.0 9868.2 10199.7 10246.5 10433.5 10220.0 10429.9 10550.7 10576.6 10693.7 03:48:47 INFO - PROCESS | 31753 | -------- Summary: end -------- 03:48:47 INFO - PROCESS | 31753 | 03:48:47 INFO - TEST-INFO | 31753: exit 0 03:48:47 INFO - TEST-OK | dromaeo_css | took 1119641ms 03:48:47 INFO - TEST-START | kraken 03:48:47 INFO - operating with platform_type : linux_ 03:48:47 INFO - Initialising browser for kraken test... 03:48:47 INFO - TEST-INFO | started process 31939 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpWbSmXh/profile http://localhost:57459/getInfo.html) 03:48:52 INFO - PROCESS | 31939 | __metrics Screen width/height:1600/1200 03:48:52 INFO - PROCESS | 31939 | colorDepth:24 03:48:52 INFO - PROCESS | 31939 | Browser inner width/height: 1024/697 03:48:52 INFO - PROCESS | 31939 | __metrics 03:48:53 INFO - PROCESS | 31939 | JavaScript error: resource://app/modules/CaptivePortalWatcher.jsm, line 60: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 03:48:54 INFO - TEST-INFO | 31939: exit 0 03:48:54 INFO - Browser initialized. 03:48:54 INFO - Running cycle 1/1 for kraken test... 03:48:54 INFO - TEST-INFO | started process 32022 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpWbSmXh/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 03:49:06 INFO - PROCESS | 32022 | RSS: Main: 158965760 03:49:06 INFO - PROCESS | 32022 | 03:49:08 INFO - PROCESS | 32022 | Cycle 1(1): loaded http://localhost:57459/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:57459/tests/kraken/driver.html?testName=audio-beat-detection) 03:49:09 INFO - PROCESS | 32022 | RSS: Main: 217309184 03:49:09 INFO - PROCESS | 32022 | 03:49:12 INFO - PROCESS | 32022 | Cycle 1(1): loaded http://localhost:57459/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:57459/tests/kraken/driver.html?testName=audio-dft) 03:49:12 INFO - PROCESS | 32022 | RSS: Main: 203632640 03:49:12 INFO - PROCESS | 32022 | 03:49:16 INFO - PROCESS | 32022 | Cycle 1(1): loaded http://localhost:57459/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:57459/tests/kraken/driver.html?testName=audio-fft) 03:49:16 INFO - PROCESS | 32022 | RSS: Main: 270970880 03:49:16 INFO - PROCESS | 32022 | 03:49:19 INFO - PROCESS | 32022 | Cycle 1(1): loaded http://localhost:57459/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:57459/tests/kraken/driver.html?testName=audio-oscillator) 03:49:19 INFO - PROCESS | 32022 | RSS: Main: 181587968 03:49:19 INFO - PROCESS | 32022 | 03:49:21 INFO - PROCESS | 32022 | Cycle 1(1): loaded http://localhost:57459/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:57459/tests/kraken/driver.html?testName=imaging-gaussian-blur) 03:49:22 INFO - PROCESS | 32022 | RSS: Main: 185581568 03:49:22 INFO - PROCESS | 32022 | 03:49:25 INFO - PROCESS | 32022 | Cycle 1(1): loaded http://localhost:57459/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:57459/tests/kraken/driver.html?testName=imaging-darkroom) 03:49:26 INFO - PROCESS | 32022 | RSS: Main: 221835264 03:49:26 INFO - PROCESS | 32022 | 03:49:29 INFO - PROCESS | 32022 | Cycle 1(1): loaded http://localhost:57459/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:57459/tests/kraken/driver.html?testName=imaging-desaturate) 03:49:30 INFO - PROCESS | 32022 | RSS: Main: 217866240 03:49:30 INFO - PROCESS | 32022 | 03:49:33 INFO - PROCESS | 32022 | Cycle 1(1): loaded http://localhost:57459/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:57459/tests/kraken/driver.html?testName=json-parse-financial) 03:49:33 INFO - PROCESS | 32022 | RSS: Main: 220405760 03:49:33 INFO - PROCESS | 32022 | 03:49:35 INFO - PROCESS | 32022 | Cycle 1(1): loaded http://localhost:57459/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:57459/tests/kraken/driver.html?testName=json-stringify-tinderbox) 03:49:36 INFO - PROCESS | 32022 | RSS: Main: 207515648 03:49:36 INFO - PROCESS | 32022 | 03:49:37 INFO - PROCESS | 32022 | Cycle 1(1): loaded http://localhost:57459/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:57459/tests/kraken/driver.html?testName=stanford-crypto-aes) 03:49:38 INFO - PROCESS | 32022 | RSS: Main: 211333120 03:49:38 INFO - PROCESS | 32022 | 03:49:40 INFO - PROCESS | 32022 | Cycle 1(1): loaded http://localhost:57459/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:57459/tests/kraken/driver.html?testName=stanford-crypto-ccm) 03:49:41 INFO - PROCESS | 32022 | RSS: Main: 210653184 03:49:41 INFO - PROCESS | 32022 | 03:49:44 INFO - PROCESS | 32022 | Cycle 1(1): loaded http://localhost:57459/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:57459/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 03:49:44 INFO - PROCESS | 32022 | RSS: Main: 230289408 03:49:44 INFO - PROCESS | 32022 | 03:49:47 INFO - PROCESS | 32022 | Cycle 1(1): loaded http://localhost:57459/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:57459/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 03:49:48 INFO - PROCESS | 32022 | RSS: Main: 225091584 03:49:48 INFO - PROCESS | 32022 | 03:49:49 INFO - PROCESS | 32022 | Cycle 1(1): loaded http://localhost:57459/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:57459/tests/kraken/driver.html?testName=ai-astar) 03:49:50 INFO - PROCESS | 32022 | RSS: Main: 267243520 03:49:50 INFO - PROCESS | 32022 | 03:49:50 INFO - PROCESS | 32022 | __start_tp_report 03:49:50 INFO - PROCESS | 32022 | _x_x_mozilla_page_load 03:49:50 INFO - PROCESS | 32022 | _x_x_mozilla_page_load_details 03:49:50 INFO - PROCESS | 32022 | |i|pagename|runs| 03:49:50 INFO - PROCESS | 32022 | |0;ai-astar;105;114;113;113;114;122;114;114;113;112 03:49:50 INFO - PROCESS | 32022 | |1;audio-beat-detection;148;122;131;174;122;123;151;121;157;128 03:49:50 INFO - PROCESS | 32022 | |2;audio-dft;161;161;161;161;160;162;161;164;161;163 03:49:50 INFO - PROCESS | 32022 | |3;audio-fft;77;77;76;123;76;76;75;76;121;78 03:49:50 INFO - PROCESS | 32022 | |4;audio-oscillator;84;86;114;84;86;84;124;84;85;125 03:49:50 INFO - PROCESS | 32022 | |5;imaging-gaussian-blur;116;118;117;117;117;117;117;117;119;117 03:49:50 INFO - PROCESS | 32022 | |6;imaging-darkroom;146;147;148;148;146;147;146;146;146;146 03:49:50 INFO - PROCESS | 32022 | |7;imaging-desaturate;95;94;95;96;95;95;95;95;95;94 03:49:50 INFO - PROCESS | 32022 | |8;json-parse-financial;64;63;64;64;64;64;63;65;64;63 03:49:50 INFO - PROCESS | 32022 | |9;json-stringify-tinderbox;64;64;64;64;65;64;64;64;64;65 03:49:50 INFO - PROCESS | 32022 | |10;stanford-crypto-aes;81;79;79;78;78;77;82;78;84;80 03:49:50 INFO - PROCESS | 32022 | |11;stanford-crypto-ccm;138;130;130;129;135;137;130;129;164;147 03:49:50 INFO - PROCESS | 32022 | |12;stanford-crypto-pbkdf2;168;168;164;165;165;169;164;171;164;164 03:49:50 INFO - PROCESS | 32022 | |13;stanford-crypto-sha256-iterative;68;68;66;67;69;69;69;68;66;66 03:49:50 INFO - PROCESS | 32022 | __end_tp_report 03:49:50 INFO - PROCESS | 32022 | __start_cc_report 03:49:50 INFO - PROCESS | 32022 | _x_x_mozilla_cycle_collect,1902 03:49:50 INFO - PROCESS | 32022 | __end_cc_report 03:49:50 INFO - PROCESS | 32022 | __startTimestamp1467456590249__endTimestamp 03:49:50 INFO - PROCESS | 32022 | 03:49:50 INFO - PROCESS | 32022 | ------- Summary: start ------- 03:49:50 INFO - PROCESS | 32022 | Number of tests: 14 03:49:50 INFO - PROCESS | 32022 | 03:49:50 INFO - PROCESS | 32022 | [#0] ai-astar Cycles:10 Average:113.40 Median:114.00 stddev:4.06 (3.6%) stddev-sans-first:2.96 03:49:50 INFO - PROCESS | 32022 | Values: 105.0 114.0 113.0 113.0 114.0 122.0 114.0 114.0 113.0 112.0 03:49:50 INFO - PROCESS | 32022 | 03:49:50 INFO - PROCESS | 32022 | [#1] audio-beat-detection Cycles:10 Average:137.70 Median:139.50 stddev:18.56 (13.3%) stddev-sans-first:19.31 03:49:50 INFO - PROCESS | 32022 | Values: 148.0 122.0 131.0 174.0 122.0 123.0 151.0 121.0 157.0 128.0 03:49:50 INFO - PROCESS | 32022 | 03:49:50 INFO - PROCESS | 32022 | [#2] audio-dft Cycles:10 Average:161.50 Median:161.00 stddev:1.18 (0.7%) stddev-sans-first:1.24 03:49:50 INFO - PROCESS | 32022 | Values: 161.0 161.0 161.0 161.0 160.0 162.0 161.0 164.0 161.0 163.0 03:49:50 INFO - PROCESS | 32022 | 03:49:50 INFO - PROCESS | 32022 | [#3] audio-fft Cycles:10 Average:85.50 Median:76.00 stddev:19.26 (25.3%) stddev-sans-first:20.18 03:49:50 INFO - PROCESS | 32022 | Values: 77.0 77.0 76.0 123.0 76.0 76.0 75.0 76.0 121.0 78.0 03:49:50 INFO - PROCESS | 32022 | 03:49:50 INFO - PROCESS | 32022 | [#4] audio-oscillator Cycles:10 Average:95.60 Median:84.00 stddev:17.78 (21.2%) stddev-sans-first:18.35 03:49:50 INFO - PROCESS | 32022 | Values: 84.0 86.0 114.0 84.0 86.0 84.0 124.0 84.0 85.0 125.0 03:49:50 INFO - PROCESS | 32022 | 03:49:50 INFO - PROCESS | 32022 | [#5] imaging-gaussian-blur Cycles:10 Average:117.20 Median:117.00 stddev:0.79 (0.7%) stddev-sans-first:0.71 03:49:50 INFO - PROCESS | 32022 | Values: 116.0 118.0 117.0 117.0 117.0 117.0 117.0 117.0 119.0 117.0 03:49:50 INFO - PROCESS | 32022 | 03:49:50 INFO - PROCESS | 32022 | [#6] imaging-darkroom Cycles:10 Average:146.60 Median:146.50 stddev:0.84 (0.6%) stddev-sans-first:0.87 03:49:50 INFO - PROCESS | 32022 | Values: 146.0 147.0 148.0 148.0 146.0 147.0 146.0 146.0 146.0 146.0 03:49:50 INFO - PROCESS | 32022 | 03:49:50 INFO - PROCESS | 32022 | [#7] imaging-desaturate Cycles:10 Average:94.90 Median:95.00 stddev:0.57 (0.6%) stddev-sans-first:0.60 03:49:50 INFO - PROCESS | 32022 | Values: 95.0 94.0 95.0 96.0 95.0 95.0 95.0 95.0 95.0 94.0 03:49:50 INFO - PROCESS | 32022 | 03:49:50 INFO - PROCESS | 32022 | [#8] json-parse-financial Cycles:10 Average:63.80 Median:64.00 stddev:0.63 (1.0%) stddev-sans-first:0.67 03:49:50 INFO - PROCESS | 32022 | Values: 64.0 63.0 64.0 64.0 64.0 64.0 63.0 65.0 64.0 63.0 03:49:50 INFO - PROCESS | 32022 | 03:49:50 INFO - PROCESS | 32022 | [#9] json-stringify-tinderbox Cycles:10 Average:64.20 Median:64.00 stddev:0.42 (0.7%) stddev-sans-first:0.44 03:49:50 INFO - PROCESS | 32022 | Values: 64.0 64.0 64.0 64.0 65.0 64.0 64.0 64.0 64.0 65.0 03:49:50 INFO - PROCESS | 32022 | 03:49:50 INFO - PROCESS | 32022 | [#10] stanford-crypto-aes Cycles:10 Average:79.60 Median:79.50 stddev:2.17 (2.7%) stddev-sans-first:2.24 03:49:50 INFO - PROCESS | 32022 | Values: 81.0 79.0 79.0 78.0 78.0 77.0 82.0 78.0 84.0 80.0 03:49:50 INFO - PROCESS | 32022 | 03:49:50 INFO - PROCESS | 32022 | [#11] stanford-crypto-ccm Cycles:10 Average:136.90 Median:136.00 stddev:11.10 (8.2%) stddev-sans-first:11.77 03:49:50 INFO - PROCESS | 32022 | Values: 138.0 130.0 130.0 129.0 135.0 137.0 130.0 129.0 164.0 147.0 03:49:50 INFO - PROCESS | 32022 | 03:49:50 INFO - PROCESS | 32022 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:166.20 Median:166.50 stddev:2.57 (1.5%) stddev-sans-first:2.65 03:49:50 INFO - PROCESS | 32022 | Values: 168.0 168.0 164.0 165.0 165.0 169.0 164.0 171.0 164.0 164.0 03:49:50 INFO - PROCESS | 32022 | 03:49:50 INFO - PROCESS | 32022 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:67.60 Median:68.00 stddev:1.26 (1.9%) stddev-sans-first:1.33 03:49:50 INFO - PROCESS | 32022 | Values: 68.0 68.0 66.0 67.0 69.0 69.0 69.0 68.0 66.0 66.0 03:49:50 INFO - PROCESS | 32022 | -------- Summary: end -------- 03:49:50 INFO - PROCESS | 32022 | 03:49:51 INFO - TEST-INFO | 32022: exit 0 03:49:51 INFO - TEST-OK | kraken | took 63332ms 03:49:51 INFO - SUITE-END | took 1182s 03:49:51 INFO - Completed test suite (00:19:43) 03:49:51 INFO - javascript benchmark 03:49:51 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"lowerIsBetter": false, "subtests": [{"name": "dojo.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [2611.777998870096, 2644.5107655083807, 2673.3183038325224, 2680.785537157028, 2690.582959641255, 4656.790444430008, 4705.623550115991, 4717.78769955352, 4783.043391321737, 4835.854924352267, 4790.0, 4798.976005119969, 4817.470078291385, 4862.2463518154655, 4866.635002374827, 4347.586979236968, 4357.586029327209, 4432.534583868695, 4454.665900057493, 4488.506264310923, 4413.735175889441, 4433.246348120827, 4456.665750068758, 4458.4204053473, 4490.797914093857, 4327.156204540101, 4370.650347972155, 4372.081862808814, 4417.624501917341, 4435.046465010038, 4341.327094300388, 4361.716488428242, 4366.214081465335, 4387.341898715186, 4421.823127074913, 4396.340548917656, 4402.097569998143, 4416.249237629579, 4446.288593824973, 4473.7986790594505, 4706.458757242926, 4789.544993225638, 4848.175810112254, 4850.975745121287, 4875.171220892421, 5248.029114613809, 5251.579873610102, 5261.0793111205385, 5269.920951185735, 5274.314339135888, 5256.894862102775, 5267.0, 5284.5772338212855, 5295.4969277918535, 5304.389995150568, 4679.485256621769, 4796.088743138793, 4823.0, 4840.0, 4928.0, 5319.601029922771, 5326.467353264643, 5375.865603359869, 5376.78492860289, 5378.9462105379225, 5068.847934561969, 5077.8730531737, 5116.360454943132, 5119.10415677255, 5150.40770311419, 5004.399472063303, 5096.05722941257, 5138.152204886152, 5162.5611822994715, 5235.685858848405, 5127.820526281637, 5139.152039913447, 5143.922841157386, 5149.407818100966, 5149.794008239628, 5120.590352771769, 5122.487751224848, 5123.436421993578, 5135.897282054413, 5167.638265321391, 4296.5273819879785, 4330.978345108254, 4331.220380331508, 4382.342648602735, 4385.561443855653, 3821.426785982125, 3860.0735823402742, 3877.0695033192396, 3878.1855810279594, 3880.78655673935, 4378.124375124988, 4411.117776444724, 4431.512533621299, 4442.044960333544, 4463.509014008457, 5152.690838549699, 5157.0, 5162.045021671003, 5164.715940623302, 5206.947930520722, 4336.457942757155, 4433.379326894237, 4434.7560884151035, 4445.59989600931, 4485.41689580359, 4602.355670206174, 4634.189016922025, 4637.513061128533, 4648.48866624671, 4650.581447669726, 4859.611231101433, 4863.10032643962, 4865.5864251539015, 4868.853934381974, 4910.48439913811, 4987.401511818605, 5155.149400348901, 5176.145935920531, 5182.041322355376, 5233.869153271199, 4850.80596776125, 4899.804007839789, 4906.779194936165, 4916.557509824133, 4960.826371076995, 5117.078925793393, 5130.0, 5140.614453916046, 5140.691558506352, 5197.0125676121415, 5062.594992400525, 5184.144616138295, 5201.687898726089, 5215.217717342429, 5234.450382709913, 5069.290299358019, 5081.9745901271735, 5083.542481176712, 5086.694798312114, 5125.2568377585785, 5083.440821509705, 5086.974565127299, 5088.465711100281, 5089.7709603067215, 5122.923156152735, 4848.442429120555, 4872.317875497362, 4918.286848407032, 4924.8276310328965, 4998.6750861193905, 5013.699178049329, 5015.623828212972, 5017.0, 5027.899442011212, 5066.974665126798, 4933.038057578881, 4935.432425271139, 4936.679115857458, 4938.604911607134, 4992.675476094042], "value": 4738.885458152436, "unit": "score"}, {"name": "ext.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [565.1466285908277, 567.2880534928664, 575.4331982996745, 579.2556564814215, 589.0957380421053, 27798.44403111939, 30351.08946731596, 30423.0, 39866.0, 41479.58520414795, 41409.0, 41954.0, 41970.37044444328, 42036.0, 42077.36883946736, 7839.804004899866, 7994.960025199865, 7995.800104997364, 7996.280334769869, 8002.399820013522, 7575.583342916138, 7748.41886858485, 7749.0701115865895, 7892.329152022085, 7995.200479951987, 10207.642732504364, 10467.685969420929, 10468.790624187512, 10807.135429165688, 10820.837687434694, 10336.224783141257, 10429.0, 10434.843477347846, 10435.217358698052, 10440.738981525446, 7560.168381478033, 9880.11079002886, 10203.795924081476, 10295.0, 10298.79402411955, 38845.61154388476, 39224.215515689524, 39240.21519569621, 39242.0, 39316.80341598302, 2185.4645611825044, 2760.8611422951217, 2840.0, 2919.2847752300822, 3295.8516866741056, 27339.726602734117, 30052.24869378261, 30363.392732145232, 30549.847250763825, 31450.0, 3426.417509023472, 3444.7801443232092, 3471.097514646185, 3484.372812893678, 3524.8766293179615, 266990.0, 267272.0, 268255.0, 268884.0, 269428.0, 56036.719816400655, 56135.43864561302, 56397.71801140968, 56444.71777641086, 56471.435285647436, 49740.75129624329, 55939.72030139823, 57092.0, 57266.141007884915, 64675.35324646787, 15034.323455444532, 15096.320665570076, 15108.697826043637, 15192.544223673307, 15195.392184312504, 11618.6514404568, 11693.473793679304, 11706.531738730355, 11709.414529273503, 11709.941450292694, 15156.621084472756, 15480.303386347641, 15489.84510154884, 16034.518964431085, 17098.572535686457, 5786.421357864264, 5963.970180149158, 6059.848628760521, 6062.575619706667, 6137.110119032715, 799.9840003199903, 866.644675682967, 943.7027336389016, 954.3319676226669, 1003.9096481316717, 28562.571561426594, 28666.713332866406, 28724.42551149007, 29048.85475572651, 29351.85324073366, 980.4901451245313, 983.9324333098525, 998.2612866478898, 1000.4847503535685, 1019.5513973851481, 14922.925385373004, 15472.458463953708, 15487.225638718019, 15689.372425103096, 15723.135227562365, 371454.0, 373239.0, 373890.0, 374530.0, 375101.0, 50323.0, 50329.24506132411, 50384.74807626012, 50394.748026260364, 50398.49601503938, 1127.6166103524677, 1153.8096214124575, 1193.0396031194798, 1196.4496331687346, 1216.2702378572785, 27147.457050859266, 28435.0, 28453.146405607866, 28477.430451390443, 28904.710952891044, 44771.07518173064, 45181.0, 45235.773821130686, 45241.0, 45279.0, 325544.0, 327319.0, 327420.0, 327852.0, 328799.0, 36818.26363472769, 38749.225015500095, 39189.216215674955, 39229.0, 39497.21005579815, 41103.38344924769, 43471.0, 43487.347689784045, 44241.55758442375, 44495.777521112184, 37484.625153748115, 37772.24455510819, 37890.2421951565, 38079.80960095182, 38135.237295253384, 36131.277374451834, 37250.44124338083, 37864.62135378611, 38044.61955380521, 38250.426243606926, 36429.81785091163, 36933.076673082316, 37200.25599488049, 37440.812795935846, 37605.2478950414, 31541.053768386984, 33054.0, 33561.0, 33948.66051339455, 34012.82993585016, 24981.87509062443, 25333.87333063323, 25551.744482554936, 26093.869530652224, 26376.20871373862], "value": 18248.48713872608, "unit": "score"}, {"name": "jquery.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [354.62055600507466, 363.9144800971772, 364.51883513761834, 369.5620689482963, 394.6842525979216, 13075.280859552733, 16219.83780162198, 17029.23368448418, 17715.379961701343, 18575.164117614706, 16819.0, 16946.661066778688, 17229.913850430763, 17469.0, 17806.82193178068, 5026.673266237701, 5222.981518603874, 5265.0259701955065, 5271.077561426735, 5387.703676297802, 3704.46285288633, 5287.259783630295, 5877.941220587803, 6191.752329906798, 6226.719797609096, 6190.907136392958, 6258.843528911791, 6271.184745983016, 6286.245650521921, 6292.056191571278, 6091.238595175603, 6263.185785847811, 6265.279492858334, 6266.749330026793, 6268.435840774307, 3355.7818741781707, 5120.308758317617, 5416.51251387377, 5432.158015507603, 5472.835814925519, 21897.671534926987, 21997.0, 22234.444138896495, 22244.666330005064, 22305.665415018786, 1836.6785812482763, 1872.3914727713411, 1914.6840771272723, 1931.2950772967906, 1939.8836069835713, 13289.136206146666, 13761.0, 13838.23889686077, 14002.0, 14340.713185736227, 1752.1589636974325, 1821.3989383503413, 1832.752578401912, 1859.4142845003917, 1866.850651947841, 70411.0, 72469.6376518114, 74147.62926185389, 74891.62554187249, 75316.0, 8368.0, 8860.64557417696, 9388.765280867896, 9711.514424278757, 9895.505224738878, 12405.503779848885, 13174.868251317555, 13263.204207747565, 13524.59426217215, 13633.454661813417, 7255.492115551966, 7487.8502429951095, 7495.437842161859, 7652.311291983749, 7784.065912090586, 7374.930635057886, 7420.814479637944, 7502.0, 7522.736704215326, 7539.283768042027, 6010.188624535632, 6186.907196392058, 6203.193584834033, 6238.688065596702, 6322.557420980487, 1730.70197351986, 1731.1603872122012, 1745.1099939030933, 1785.2501949181114, 1795.2998330651058, 829.6764261937849, 857.1000449528095, 871.8822958900594, 873.2969959182792, 881.7178502879017, 17743.290268389377, 17805.554861128316, 18128.637427251644, 18139.54651133732, 18489.795108792467, 828.883956246126, 836.6611522333465, 837.7810286033806, 843.6709683223547, 895.0333639669142, 9886.357386769838, 10103.949480252699, 10306.742331441625, 10314.27800053989, 10390.948045259876, 403483.0, 404458.0, 410486.0, 411978.0, 412241.0, 71030.28969710237, 71462.0, 72972.0, 73416.29128941384, 74463.62768186124, 874.191372979991, 881.2553392383426, 881.6341218394294, 886.0519244408421, 895.6283142495791, 14644.065086954099, 15808.209589520708, 15966.28151733198, 16169.434069807501, 16426.096564688578, 23863.227937248448, 29627.40745185041, 36248.27503449969, 36369.81815090908, 36581.0, 45170.870728232054, 45487.09025819399, 45668.0, 45786.54213457823, 46064.0, 7491.688954432843, 7610.12483564375, 7649.502782319131, 7680.423968202295, 7846.882296765667, 11702.531898723955, 12185.147039707135, 12208.450619721956, 12280.201786883825, 12449.75100497967, 10309.74225644365, 10318.277720559488, 10335.741606459598, 10382.740431488972, 10530.526126324181, 10594.947025264824, 10636.52135653882, 10774.730631733955, 10827.242093053726, 10863.348199108079, 10420.68737937863, 10571.788564228826, 10753.838692419777, 10811.35131892089, 11016.1187105033, 7445.813854653677, 7529.736459223901, 7559.055118110236, 7601.923980760122, 7635.732749353968, 10514.789704206027, 10667.306625069656, 10706.518206680874, 10733.516991735547, 10736.570537178737], "value": 8471.05329904374, "unit": "score"}, {"name": "mootools.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [1376.3393571085878, 1398.2798858587828, 1456.3155317001012, 1676.4802911097568, 1680.15992003998, 7526.661300241489, 7929.881051784228, 8039.79900502487, 8077.596120193996, 8079.717209897654, 6964.233934267227, 7435.516691415054, 7657.3874090072795, 7695.653695583698, 7911.327537159334, 2267.9319620411416, 2297.058206135485, 2299.2067736630834, 2300.1834348806183, 2303.1248125712204, 2217.39021769014, 2254.966175507369, 2298.436882963668, 2301.6432452969734, 2310.676505289261, 1940.2433051110079, 2188.8139508141826, 2255.6616507523922, 2259.2996171186983, 2263.6265016272296, 2292.7248730152323, 2298.310506847939, 2317.7450480447137, 2331.3239160643393, 2331.895064722083, 2263.3323169664823, 2282.3837563857664, 2286.1312701173615, 2286.748457669655, 2287.176616418088, 8063.27430531255, 8111.837763244761, 8121.147279535623, 8127.187281271885, 8130.430869839054, 4663.27719203524, 4751.904961900743, 4787.473377928425, 4793.089313030513, 4794.256890182028, 2847.5870998705072, 2947.7199666031693, 2972.1232236490287, 2986.656534498539, 2997.640283166012, 934.8831396075491, 945.5366870233605, 952.3429233134297, 959.9280053995979, 960.1454705312277, 10869.347839129678, 10870.347779133277, 10879.564817407374, 10888.074513666348, 10890.945545272223, 4316.244657185043, 4420.336949457543, 4436.622887054572, 4637.188492013884, 4653.95346046542, 8544.444611100258, 8558.743237702878, 8628.094050124771, 8628.827423451496, 8631.093735157718, 4705.458872229738, 4739.241721324572, 4742.146413645508, 4743.288506724019, 4745.83389581363, 4295.8496452624, 4406.669499787465, 4409.603135717801, 4412.646988240933, 4441.111777644484, 3410.710089642408, 3417.094469965461, 3458.8097654629237, 3480.3735327641266, 3507.5440192774777, 990.222675199979, 1017.6692574913183, 1038.8182068138046, 1064.8402739589123, 1067.3649178738638, 786.217713375184, 858.5315326082557, 859.7850537365658, 892.7991201979503, 904.0778406025817, 5257.132573125468, 5394.838154855361, 5414.566834653218, 5579.107342825209, 5611.242482264924, 831.3141658132065, 844.8817165596821, 854.1415877043655, 891.9598618062203, 903.584351198443, 3654.775650157227, 3838.1172330364175, 3844.8077596120083, 3880.165764360676, 4058.6347228749555, 9828.901710982942, 9940.254480913816, 9946.850797238047, 10063.748406289755, 10098.545565449573, 9000.50497222646, 9025.503597302211, 9853.704388868346, 10005.54975026111, 10027.598896044223, 7200.603966781878, 7421.703131874772, 7597.050368703912, 7611.809704757315, 7613.771586852404, 5430.131179011497, 5497.120460726264, 5516.117421212587, 5571.749271282721, 5688.089905615082, 8636.17956294151, 8921.955390223007, 8935.553222338727, 9110.635574576943, 9162.954185229031, 8749.650013999624, 9126.224270937044, 9133.0, 9236.168744813, 9265.490398027903, 7645.694172233048, 7700.884486732815, 7716.112647045662, 7732.342750866239, 7808.609569521387, 7743.2643898831775, 7747.651355688895, 7792.064952205772, 7807.453478256694, 7811.257930496594, 6908.171019477695, 6917.204521480095, 7148.392386647193, 7149.320814522612, 7265.382442492236, 6885.483588730765, 6887.381465355537, 6920.411765000032, 6972.965135174494, 7058.505904586835, 6526.412622863965, 6601.768938087144, 6647.7008534617025, 6655.168103987002, 6656.633885136364, 4807.533702220856, 4816.373871396696, 4820.1805693031565, 4827.686200396963, 4875.536824001714, 4725.8582242532775, 4786.521347865186, 4815.30178124163, 4822.228443449031, 4832.106060378841], "value": 4251.410701389089, "unit": "score"}, {"name": "prototype.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [287.649068136873, 295.6880491081908, 297.2894781472282, 307.0297858766299, 308.71289700578467, 4665.370175026371, 4807.0, 4882.8779280518, 4942.159832828419, 4950.826721064764, 4696.765161741908, 4816.217999340241, 4828.613710903128, 4833.4924832892475, 4835.661503694742, 3829.5404551453867, 3846.288436639217, 3853.344931361675, 3864.1692036212207, 3872.67082298005, 3657.6159503252175, 3727.1986522897573, 3848.942265866014, 3878.9030274243087, 3885.164689591737, 3820.0640842993507, 3824.6749026332654, 3830.9616903830884, 3834.731568790186, 3835.7506762060375, 3810.6951443884423, 3813.961860381416, 3839.0037180666036, 3844.2119365529998, 3863.864764733249, 3386.72906167506, 3387.915302117442, 3404.438267685829, 3408.812515311657, 3414.897553073412, 4581.541845815425, 4707.529247075299, 4731.195696731564, 4741.122892264942, 4750.8337208197545, 4360.781960901974, 4362.563743625612, 4369.0, 4373.825046998148, 4390.914315700049, 5035.093683137034, 5039.118154322979, 5060.544550990428, 5093.236014597803, 5128.820371314619, 3611.368010598161, 3730.9067273318115, 3736.682381997506, 3738.6635202831603, 3742.0457783265365, 5266.183741520071, 5268.3404727510715, 5272.393674727417, 5297.735113244361, 5300.2314664373835, 3786.469894214812, 3795.5065841440987, 3799.4870692456166, 3805.4862593549515, 3826.3686491728554, 3784.924301513954, 3867.671247943956, 3883.786391748481, 3887.8639247626197, 3893.5717071122153, 4298.871033868989, 4306.332518459643, 4330.133973205371, 4339.609435150788, 4361.498427680794, 4993.925091123636, 5016.899662006813, 5024.49755024502, 5057.848264552069, 5084.8220312288895, 1251.6432816647393, 1289.7936330187124, 1327.4756471193825, 1332.160738734591, 1335.30564106664, 902.4495058014605, 911.8541033434618, 928.1600151862575, 933.0855761353911, 937.7655586103474, 4447.710898791568, 4449.57729015743, 4465.464144302639, 4471.7987690554, 4489.708168969007, 5124.641275110781, 5134.589232861362, 5135.79308862417, 5146.974265128651, 5148.922766158511, 4336.251804274315, 4441.311596702516, 4447.666425018072, 4463.35281384204, 4481.148581769454, 2376.7623237676094, 2461.289403864297, 2472.6909136357954, 2475.9752402476106, 2482.255323402972, 4324.56754324565, 4377.233984052778, 4392.890177745518, 4405.185040767468, 4417.558244175621, 4728.1252968201, 4751.239801631722, 4755.48094410134, 4756.524347565216, 4765.237561990065, 4197.622214000755, 4286.885409793414, 4352.956470435319, 4377.97117677352, 4383.408239887638, 4591.632669386508, 4628.143793398098, 4629.213033784332, 4640.675152739276, 4651.209294419889, 4529.365888775508, 4555.293929440942, 4557.680962332605, 4565.3836732040745, 4583.335416364675, 4095.0, 4335.653147748236, 4374.1907747065625, 4387.802548885372, 4417.094495628453, 3421.886083663854, 3439.570053743282, 3449.8098156136093, 3479.7216222702627, 3481.7736847104857, 4653.906921861476, 4655.441347038377, 4667.719936803803, 4698.882527936829, 5044.192929131322, 4879.243717223836, 5051.368578927634, 5057.266696329085, 5074.213496907985, 5087.4149472811105, 5055.977608956447, 5095.515925987025, 5098.388193416814, 5100.724818795301, 5110.160342276703, 4876.21980483121, 5009.373828271466, 5048.570871475818, 5062.215356619583, 5080.796768129233, 5119.308893299357, 5123.666961647481, 5123.897522049613, 5125.077486052546, 5135.2553879687985, 4998.6750861193905, 5014.899702006012, 5037.496250375079, 5038.697678139323, 5069.9746501267255], "value": 3746.775509319163, "unit": "score"}, {"name": "yui.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [659.7591878964176, 663.2273401487267, 670.5942904542754, 705.7247673407369, 757.4849102610225, 12555.560555380564, 13973.301334933238, 13978.510752123677, 13987.860121398782, 13990.650233744162, 12401.689957751061, 12547.247165170073, 12699.873001269985, 13129.343532823368, 13233.338333083355, 779.3531368963746, 785.8978332816725, 792.9484583502054, 794.8608993426157, 795.7891158842912, 628.4406877878691, 767.1369709077288, 793.6309616028545, 797.3581267079999, 799.8440304140695, 820.3847114664002, 820.7619790260848, 823.9423240373176, 824.0770337222319, 824.2416976381713, 650.3204151661478, 814.7840822182097, 818.7830224990382, 821.8726097454934, 822.9917700823005, 584.0, 603.5714642603757, 605.315992927993, 606.4329851588778, 607.7265230646227, 12950.028747843855, 13005.869941300654, 13013.869861301455, 13024.153430027112, 13089.083764136514, 11361.318320900773, 11566.190366674336, 11994.100442466763, 12296.754064918741, 12578.245305281622, 10586.258961872594, 10647.201459890539, 10729.9463502682, 10751.086157676607, 10792.244542882001, 4001.799910004488, 4004.979975100135, 4084.7140700151003, 4088.8773336799945, 4168.91662166758, 56094.15858762122, 57012.714936425466, 57526.0, 57801.71099144477, 58311.70844145752, 9788.608455661693, 10050.346727462691, 10128.088472037552, 10139.138173255356, 10273.332233404954, 19432.2227110914, 20886.895565522074, 20977.89511052435, 20985.055672494775, 21022.78977210208, 7228.277172282729, 7300.525465844703, 7358.742444014434, 7407.185209626937, 7429.591372474458, 3802.1825307559006, 3857.4213867920034, 3880.611938806097, 3952.980235098806, 4006.2788698034633, 2922.4885645012464, 3023.7580993520464, 3024.380002099564, 3025.8638361273797, 3026.2585666511404, 520.0690763533308, 522.4462070205518, 529.1190168369699, 529.6768970927731, 539.5440852479649, 505.3455774771679, 535.9517643412033, 567.140781715701, 581.4970050905936, 586.9090291004901, 8412.747617571482, 8415.663373465115, 8642.956785216034, 8802.251808596213, 8804.691835785845, 577.8295402856168, 579.4090028171325, 598.4464370457309, 603.809799913026, 612.3784358875745, 4328.177646247203, 4570.360149579062, 4729.7398643074275, 4901.705897646153, 4934.407871055496, 77096.0, 80049.59975200087, 80113.0, 87100.0, 102029.48985255026, 77181.61409192918, 79057.60471197608, 79082.0, 79409.60295198487, 79654.42419030728, 69887.65056174686, 71406.64296678483, 71966.64016679987, 72121.6393918027, 72875.63562182155, 8842.115788421106, 8973.955130224569, 9093.454392736458, 9320.906790932004, 9345.392549484262, 41661.166776664904, 41984.58015419807, 42284.57715422806, 42390.0, 42861.571384287, 57071.0, 61263.38736612755, 62073.37926620676, 62638.373616263256, 64244.67877660582, 11318.94340528292, 11597.246178998676, 11688.0, 11846.11154163424, 12240.265584064984, 12718.491260349852, 12734.299613521345, 12928.288944108164, 13600.310500283804, 13749.381277842322, 12105.818412723993, 12350.0, 12633.494660213857, 12753.501568463143, 13118.803217951929, 12257.938710306391, 12398.5660501882, 12442.315672638091, 12568.245905245714, 13009.674758131123, 12247.571335003233, 12855.228686278853, 12914.0, 13049.869501304865, 13171.60485185446, 9567.952160239154, 9868.210543156387, 10199.694009179737, 10246.487675616338, 10433.478326083514, 10220.0, 10429.947850261004, 10550.736231594272, 10576.576936922746, 10693.679189624323], "value": 6692.893599364795, "unit": "score"}], "name": "dromaeo_css", "value": 6538.067108241319, "alertThreshold": 5.0}, {"lowerIsBetter": true, "subtests": [{"name": "ai-astar", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [105.0, 114.0, 113.0, 113.0, 114.0, 122.0, 114.0, 114.0, 113.0, 112.0], "value": 113.4, "unit": "score"}, {"name": "audio-beat-detection", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [148.0, 122.0, 131.0, 174.0, 122.0, 123.0, 151.0, 121.0, 157.0, 128.0], "value": 137.7, "unit": "score"}, {"name": "audio-dft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [161.0, 161.0, 161.0, 161.0, 160.0, 162.0, 161.0, 164.0, 161.0, 163.0], "value": 161.5, "unit": "score"}, {"name": "audio-fft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [77.0, 77.0, 76.0, 123.0, 76.0, 76.0, 75.0, 76.0, 121.0, 78.0], "value": 85.5, "unit": "score"}, {"name": "audio-oscillator", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [84.0, 86.0, 114.0, 84.0, 86.0, 84.0, 124.0, 84.0, 85.0, 125.0], "value": 95.6, "unit": "score"}, {"name": "imaging-gaussian-blur", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [116.0, 118.0, 117.0, 117.0, 117.0, 117.0, 117.0, 117.0, 119.0, 117.0], "value": 117.2, "unit": "score"}, {"name": "imaging-darkroom", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [146.0, 147.0, 148.0, 148.0, 146.0, 147.0, 146.0, 146.0, 146.0, 146.0], "value": 146.6, "unit": "score"}, {"name": "imaging-desaturate", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [95.0, 94.0, 95.0, 96.0, 95.0, 95.0, 95.0, 95.0, 95.0, 94.0], "value": 94.9, "unit": "score"}, {"name": "json-parse-financial", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [64.0, 63.0, 64.0, 64.0, 64.0, 64.0, 63.0, 65.0, 64.0, 63.0], "value": 63.8, "unit": "score"}, {"name": "json-stringify-tinderbox", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [64.0, 64.0, 64.0, 64.0, 65.0, 64.0, 64.0, 64.0, 64.0, 65.0], "value": 64.2, "unit": "score"}, {"name": "stanford-crypto-aes", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [81.0, 79.0, 79.0, 78.0, 78.0, 77.0, 82.0, 78.0, 84.0, 80.0], "value": 79.6, "unit": "score"}, {"name": "stanford-crypto-ccm", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [138.0, 130.0, 130.0, 129.0, 135.0, 137.0, 130.0, 129.0, 164.0, 147.0], "value": 136.9, "unit": "score"}, {"name": "stanford-crypto-pbkdf2", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [168.0, 168.0, 164.0, 165.0, 165.0, 169.0, 164.0, 171.0, 164.0, 164.0], "value": 166.2, "unit": "score"}, {"name": "stanford-crypto-sha256-iterative", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [68.0, 68.0, 66.0, 67.0, 69.0, 69.0, 69.0, 68.0, 66.0, 66.0], "value": 67.6, "unit": "score"}], "name": "kraken", "value": 1530.7, "alertThreshold": 2.0}]} 03:49:51 INFO - Return code: 0 03:49:51 INFO - Validating PERFHERDER_DATA against /builds/slave/test/scripts/external_tools/performance-artifact-schema.json 03:49:51 INFO - # TBPL SUCCESS # 03:49:51 INFO - Running post-action listener: _resource_record_post_action 03:49:51 INFO - ##### 03:49:51 INFO - ##### Finished run-tests step (success) 03:49:51 INFO - ##### 03:49:51 INFO - Running post-run listener: _resource_record_post_run 03:49:51 INFO - Total resource usage - Wall time: 1200s; CPU: 13.0%; Read bytes: 4096; Write bytes: 534433792; Read time: 12; Write time: 469316 03:49:51 INFO - TinderboxPrint: CPU usage
13.0% 03:49:51 INFO - TinderboxPrint: I/O read bytes / time
4,096 / 12 03:49:51 INFO - TinderboxPrint: I/O write bytes / time
534,433,792 / 469,316 03:49:51 INFO - TinderboxPrint: CPU idle
8,328.3 (87.0%) 03:49:51 INFO - TinderboxPrint: CPU user
1,205.7 (12.6%) 03:49:51 INFO - TinderboxPrint: Swap in / out
0 / 0 03:49:51 INFO - install - Wall time: 17s; CPU: 14.0%; Read bytes: 0; Write bytes: 246046720; Read time: 0; Write time: 260048 03:49:51 INFO - run-tests - Wall time: 1184s; CPU: 13.0%; Read bytes: 0; Write bytes: 288387072; Read time: 0; Write time: 209268 03:49:52 INFO - Running post-run listener: _upload_blobber_files 03:49:52 INFO - Blob upload gear active. 03:49:52 INFO - Preparing to upload files from /builds/slave/test/build/blobber_upload_dir. 03:49:52 INFO - Files from /builds/slave/test/build/blobber_upload_dir are to be uploaded with branch at the following location(s): https://blobupload.elasticbeanstalk.com 03:49:52 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/venv/bin/blobberc.py', '-u', 'https://blobupload.elasticbeanstalk.com', '-a', '/builds/slave/test/oauth.txt', '-b', 'Firefox-Non-PGO', '-d', '/builds/slave/test/build/blobber_upload_dir', '--output-manifest', '/builds/slave/test/build/uploaded_files.json'] 03:49:52 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/venv/bin/blobberc.py -u https://blobupload.elasticbeanstalk.com -a /builds/slave/test/oauth.txt -b Firefox-Non-PGO -d /builds/slave/test/build/blobber_upload_dir --output-manifest /builds/slave/test/build/uploaded_files.json 03:49:52 INFO - (blobuploader) - INFO - Open directory for files ... 03:49:52 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log ... 03:49:52 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 03:49:52 INFO - (blobuploader) - INFO - Uploading, attempt #1. 03:49:53 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs_raw.log: uploaded 03:49:53 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 03:49:53 INFO - (blobuploader) - INFO - Done attempting. 03:49:53 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/resource-usage.json ... 03:49:53 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 03:49:53 INFO - (blobuploader) - INFO - Uploading, attempt #1. 03:49:56 INFO - (blobuploader) - INFO - TinderboxPrint: resource-usage.json: uploaded 03:49:56 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 03:49:56 INFO - (blobuploader) - INFO - Done attempting. 03:49:56 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log ... 03:49:56 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 03:49:56 INFO - (blobuploader) - INFO - Uploading, attempt #1. 03:49:57 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs_errorsummary.log: uploaded 03:49:57 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 03:49:57 INFO - (blobuploader) - INFO - Done attempting. 03:49:57 INFO - (blobuploader) - INFO - Iteration through files over. 03:49:57 INFO - Return code: 0 03:49:57 INFO - rmtree: /builds/slave/test/build/uploaded_files.json 03:49:57 INFO - retry: Calling remove with args: ('/builds/slave/test/build/uploaded_files.json',), kwargs: {}, attempt #1 03:49:57 INFO - Setting buildbot property blobber_files to {"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/bfe1afbdc141672c4e8ba5438c6f0085b700c7798a2daf92901f53f2b3b004554b3509c7a5644fb1e63c81106d3b6d5e7269707552424260f8f5df9a5174ccf7", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/5722e052b046437f6467eafc81289e43ad7d4e497303bde0e6fe1ba421a433ebbac03abfbb2800512795b6e8316f6e16d801fcc355305885b8955f95245621df", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/76e48254c9162479d4e5d92d27444ffa7ae9f7b1909c39899f8e62f1ce35c1afc586fe0c1c04ed74ed5d8eadf63fa122a695c74916325dd65b743f496a849e48"} 03:49:57 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test/properties/blobber_files 03:49:57 INFO - Writing to file /builds/slave/test/properties/blobber_files 03:49:57 INFO - Contents: 03:49:57 INFO - blobber_files:{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/bfe1afbdc141672c4e8ba5438c6f0085b700c7798a2daf92901f53f2b3b004554b3509c7a5644fb1e63c81106d3b6d5e7269707552424260f8f5df9a5174ccf7", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/5722e052b046437f6467eafc81289e43ad7d4e497303bde0e6fe1ba421a433ebbac03abfbb2800512795b6e8316f6e16d801fcc355305885b8955f95245621df", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/76e48254c9162479d4e5d92d27444ffa7ae9f7b1909c39899f8e62f1ce35c1afc586fe0c1c04ed74ed5d8eadf63fa122a695c74916325dd65b743f496a849e48"} 03:49:57 INFO - Running post-run listener: copy_logs_to_upload_dir 03:49:57 INFO - Copying logs to upload dir... 03:49:57 INFO - mkdir: /builds/slave/test/build/upload/logs 03:49:57 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1251.402665 ========= master_lag: 0.03 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 51 secs) (at 2016-07-02 03:49:57.113704) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-07-02 03:49:57.117168) ========= 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=9c3a94c35cc88655b05d2c08000001b2-1467454824.188659-1286726705 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False blobber_files:{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/bfe1afbdc141672c4e8ba5438c6f0085b700c7798a2daf92901f53f2b3b004554b3509c7a5644fb1e63c81106d3b6d5e7269707552424260f8f5df9a5174ccf7", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/5722e052b046437f6467eafc81289e43ad7d4e497303bde0e6fe1ba421a433ebbac03abfbb2800512795b6e8316f6e16d801fcc355305885b8955f95245621df", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/76e48254c9162479d4e5d92d27444ffa7ae9f7b1909c39899f8e62f1ce35c1afc586fe0c1c04ed74ed5d8eadf63fa122a695c74916325dd65b743f496a849e48"} build_url:https://queue.taskcluster.net/v1/task/OP82OBfxQyasCgzP8SZffA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 program finished with exit code 0 elapsedTime=0.011183 build_url: 'https://queue.taskcluster.net/v1/task/OP82OBfxQyasCgzP8SZffA/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2' blobber_files: '{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/bfe1afbdc141672c4e8ba5438c6f0085b700c7798a2daf92901f53f2b3b004554b3509c7a5644fb1e63c81106d3b6d5e7269707552424260f8f5df9a5174ccf7", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/5722e052b046437f6467eafc81289e43ad7d4e497303bde0e6fe1ba421a433ebbac03abfbb2800512795b6e8316f6e16d801fcc355305885b8955f95245621df", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/76e48254c9162479d4e5d92d27444ffa7ae9f7b1909c39899f8e62f1ce35c1afc586fe0c1c04ed74ed5d8eadf63fa122a695c74916325dd65b743f496a849e48"}' ========= master_lag: 0.02 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-07-02 03:49:57.144989) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-07-02 03:49:57.145531) ========= 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=9c3a94c35cc88655b05d2c08000001b2-1467454824.188659-1286726705 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004443 ========= master_lag: 0.08 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-07-02 03:49:57.229097) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2016-07-02 03:49:57.229705) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2016-07-02 03:49:57.230307) ========= ========= Total master_lag: 0.22 =========