builder: mozilla-central_ubuntu64_hw_test-dromaeojs-e10s slave: talos-linux64-ix-021 starttime: 1469031755.07 results: success (0) buildid: 20160720075127 builduid: f00e7fa9d5804604943e4f11ae887bfe revision: ee1973d27f13e5adc7d41a8917c097266ec907b7 ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2016-07-20 09:22:35.071404) ========= master: http://buildbot-master104.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2016-07-20 09:22:35.071868) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-07-20 09:22:35.072141) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-07-20 09:22:35.088337) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-07-20 09:22:35.088728) ========= bash -c 'wget -Oarchiver_client.py --no-check-certificate --tries=10 --waitretry=3 https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py' in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', 'wget -Oarchiver_client.py --no-check-certificate --tries=10 --waitretry=3 https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=df17445c3590ff7897617a0e00000225-1469031754.342282-285633841 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2016-07-20 09:22:35-- https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py Resolving hg.mozilla.org (hg.mozilla.org)... 63.245.215.102, 63.245.215.25 Connecting to hg.mozilla.org (hg.mozilla.org)|63.245.215.102|:443... connected. HTTP request sent, awaiting response... 200 Script output follows Length: 12141 (12K) [text/x-python] Saving to: `archiver_client.py' 0K .......... . 100% 95.6M=0s 2016-07-20 09:22:35 (95.6 MB/s) - `archiver_client.py' saved [12141/12141] program finished with exit code 0 elapsedTime=0.078471 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-07-20 09:22:35.181249) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-07-20 09:22:35.181561) ========= 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=df17445c3590ff7897617a0e00000225-1469031754.342282-285633841 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.015240 ========= master_lag: 0.03 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-07-20 09:22:35.231105) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 1 secs) (at 2016-07-20 09:22:35.231498) ========= bash -c 'python archiver_client.py mozharness --repo mozilla-central --rev ee1973d27f13e5adc7d41a8917c097266ec907b7 --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 ee1973d27f13e5adc7d41a8917c097266ec907b7 --destination scripts --debug'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=df17445c3590ff7897617a0e00000225-1469031754.342282-285633841 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2016-07-20 09:22:35,330 truncating revision to first 12 chars 2016-07-20 09:22:35,330 Setting DEBUG logging. 2016-07-20 09:22:35,330 attempt 1/10 2016-07-20 09:22:35,330 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/mozilla-central/ee1973d27f13?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2016-07-20 09:22:35,946 unpacking tar archive at: mozilla-central-ee1973d27f13/testing/mozharness/ program finished with exit code 0 elapsedTime=0.992422 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 1 secs) (at 2016-07-20 09:22:36.238057) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-07-20 09:22:36.238397) ========= script_repo_revision: ee1973d27f13e5adc7d41a8917c097266ec907b7 ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-07-20 09:22:36.238810) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-07-20 09:22:36.239083) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-07-20 09:22:36.248532) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 49 secs) (at 2016-07-20 09:22:36.248822) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs-e10s --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-e10s', '--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=df17445c3590ff7897617a0e00000225-1469031754.342282-285633841 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 09:22:36 INFO - MultiFileLogger online at 20160720 09:22:36 in /builds/slave/test 09:22:36 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs-e10s --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 09:22:36 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 09:22:36 INFO - {'append_to_log': False, 09:22:36 INFO - 'base_work_dir': '/builds/slave/test', 09:22:36 INFO - 'blob_upload_branch': 'Firefox-Non-PGO', 09:22:36 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 09:22:36 INFO - 'branch': 'Firefox-Non-PGO', 09:22:36 INFO - 'buildbot_json_path': 'buildprops.json', 09:22:36 INFO - 'config_files': ('talos/linux_config.py',), 09:22:36 INFO - 'default_actions': ('clobber', 09:22:36 INFO - 'read-buildbot-config', 09:22:36 INFO - 'download-and-extract', 09:22:36 INFO - 'populate-webroot', 09:22:36 INFO - 'create-virtualenv', 09:22:36 INFO - 'install', 09:22:36 INFO - 'run-tests'), 09:22:36 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 09:22:36 INFO - 'download_minidump_stackwalk': True, 09:22:36 INFO - 'download_symbols': 'ondemand', 09:22:36 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 09:22:36 INFO - 'tooltool.py': '/tools/tooltool.py', 09:22:36 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 09:22:36 INFO - '/tools/misc-python/virtualenv.py')}, 09:22:36 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 09:22:36 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 09:22:36 INFO - 'installer_path': 'installer.exe', 09:22:36 INFO - 'log_level': 'info', 09:22:36 INFO - 'log_name': 'talos', 09:22:36 INFO - 'log_to_console': True, 09:22:36 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 09:22:36 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 09:22:36 INFO - 'opt_config_files': (), 09:22:36 INFO - 'pip_index': False, 09:22:36 INFO - 'sps_profile': False, 09:22:36 INFO - 'sps_profile_interval': 0, 09:22:36 INFO - 'suite': 'dromaeojs-e10s', 09:22:36 INFO - 'system_bits': '32', 09:22:36 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 09:22:36 INFO - 'title': 'talos-linux64-ix-021', 09:22:36 INFO - 'tooltool_cache': '/builds/tooltool_cache', 09:22:36 INFO - 'use_talos_json': True, 09:22:36 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 09:22:36 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 09:22:36 INFO - 'work_dir': 'build'} 09:22:36 INFO - [mozharness: 2016-07-20 16:22:36.430244Z] Running clobber step. 09:22:36 INFO - Running pre-action listener: _resource_record_pre_action 09:22:36 INFO - Running main action method: clobber 09:22:36 INFO - rmtree: /builds/slave/test/build 09:22:36 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 09:22:36 INFO - Running post-action listener: _resource_record_post_action 09:22:36 INFO - [mozharness: 2016-07-20 16:22:36.903123Z] Finished clobber step (success) 09:22:36 INFO - [mozharness: 2016-07-20 16:22:36.903225Z] Running read-buildbot-config step. 09:22:36 INFO - Running pre-action listener: _resource_record_pre_action 09:22:36 INFO - Running main action method: read_buildbot_config 09:22:36 INFO - Using buildbot properties: 09:22:36 INFO - { 09:22:36 INFO - "project": "", 09:22:36 INFO - "product": "firefox", 09:22:36 INFO - "script_repo_revision": "production", 09:22:36 INFO - "builddir": "mozilla-central_ubuntu64_hw_test-dromaeojs-e10s", 09:22:36 INFO - "repository": "", 09:22:36 INFO - "buildername": "Ubuntu HW 12.04 x64 mozilla-central talos dromaeojs-e10s", 09:22:36 INFO - "buildid": "20160720075127", 09:22:36 INFO - "pgo_build": "False", 09:22:36 INFO - "basedir": "/builds/slave/test", 09:22:36 INFO - "buildnumber": 387, 09:22:36 INFO - "slavename": "talos-linux64-ix-021", 09:22:36 INFO - "master": "http://buildbot-master104.bb.releng.scl3.mozilla.com:8201/", 09:22:36 INFO - "platform": "ubuntu64_hw", 09:22:36 INFO - "scheduler": "tests-mozilla-central-linux64-talos", 09:22:36 INFO - "branch": "mozilla-central", 09:22:36 INFO - "repo_path": "mozilla-central", 09:22:36 INFO - "revision": "ee1973d27f13e5adc7d41a8917c097266ec907b7", 09:22:36 INFO - "stage_platform": "linux64", 09:22:36 INFO - "builduid": "f00e7fa9d5804604943e4f11ae887bfe", 09:22:36 INFO - "slavebuilddir": "test" 09:22:36 INFO - } 09:22:36 INFO - Found installer url https://queue.taskcluster.net/v1/task/UteF4m_nQPGrd8te-ixgUg/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2. 09:22:36 INFO - Running post-action listener: _resource_record_post_action 09:22:36 INFO - [mozharness: 2016-07-20 16:22:36.905892Z] Finished read-buildbot-config step (success) 09:22:36 INFO - [mozharness: 2016-07-20 16:22:36.905981Z] Running download-and-extract step. 09:22:36 INFO - Running pre-action listener: _resource_record_pre_action 09:22:36 INFO - Running main action method: download_and_extract 09:22:36 INFO - mkdir: /builds/slave/test/build/tests 09:22:36 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')]} 09:22:36 INFO - https://queue.taskcluster.net/v1/task/UteF4m_nQPGrd8te-ixgUg/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.test_packages.json matches https://queue.taskcluster.net 09:22:36 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/UteF4m_nQPGrd8te-ixgUg/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.test_packages.json 09:22:36 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/UteF4m_nQPGrd8te-ixgUg/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.test_packages.json 09:22:36 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/UteF4m_nQPGrd8te-ixgUg/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 09:22:36 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/UteF4m_nQPGrd8te-ixgUg/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 09:22:37 INFO - Downloaded 1361 bytes. 09:22:37 INFO - Reading from file /builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.test_packages.json 09:22:37 INFO - Using the following test package requirements: 09:22:37 INFO - {u'common': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip'], 09:22:37 INFO - u'cppunittest': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 09:22:37 INFO - u'firefox-50.0a1.en-US.linux-x86_64.cppunittest.tests.zip'], 09:22:37 INFO - u'gtest': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 09:22:37 INFO - u'firefox-50.0a1.en-US.linux-x86_64.gtest.tests.zip'], 09:22:37 INFO - u'jittest': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 09:22:37 INFO - u'jsshell-linux-x86_64.zip'], 09:22:37 INFO - u'mochitest': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 09:22:37 INFO - u'firefox-50.0a1.en-US.linux-x86_64.mochitest.tests.zip'], 09:22:37 INFO - u'mozbase': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip'], 09:22:37 INFO - u'reftest': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 09:22:37 INFO - u'firefox-50.0a1.en-US.linux-x86_64.reftest.tests.zip'], 09:22:37 INFO - u'talos': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 09:22:37 INFO - u'firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip'], 09:22:37 INFO - u'web-platform': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 09:22:37 INFO - u'firefox-50.0a1.en-US.linux-x86_64.web-platform.tests.zip'], 09:22:37 INFO - u'xpcshell': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 09:22:37 INFO - u'firefox-50.0a1.en-US.linux-x86_64.xpcshell.tests.zip']} 09:22:37 INFO - Downloading packages: [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip'] for test suite category: common 09:22: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')]} 09:22:37 INFO - https://queue.taskcluster.net/v1/task/UteF4m_nQPGrd8te-ixgUg/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 09:22:37 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/UteF4m_nQPGrd8te-ixgUg/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip 09:22:37 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/UteF4m_nQPGrd8te-ixgUg/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip 09:22:37 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/UteF4m_nQPGrd8te-ixgUg/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 09:22:37 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/UteF4m_nQPGrd8te-ixgUg/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 09:22:38 INFO - Downloaded 22771726 bytes. 09:22:38 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'] 09:22:38 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 09:22:40 INFO - Return code: 0 09:22:40 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 09:22: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')]} 09:22:40 INFO - https://queue.taskcluster.net/v1/task/UteF4m_nQPGrd8te-ixgUg/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 09:22:40 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/UteF4m_nQPGrd8te-ixgUg/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip 09:22:40 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/UteF4m_nQPGrd8te-ixgUg/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip 09:22:40 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/UteF4m_nQPGrd8te-ixgUg/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 09:22:40 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/UteF4m_nQPGrd8te-ixgUg/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 09:22:41 INFO - Downloaded 22771726 bytes. 09:22:41 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'] 09:22:41 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 09:22:42 INFO - Return code: 0 09:22:42 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')]} 09:22:42 INFO - https://queue.taskcluster.net/v1/task/UteF4m_nQPGrd8te-ixgUg/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip matches https://queue.taskcluster.net 09:22:42 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/UteF4m_nQPGrd8te-ixgUg/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip 09:22:42 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/UteF4m_nQPGrd8te-ixgUg/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip 09:22:42 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/UteF4m_nQPGrd8te-ixgUg/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 09:22:42 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/UteF4m_nQPGrd8te-ixgUg/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 09:22:43 INFO - Downloaded 14403317 bytes. 09:22:43 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'] 09:22:43 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 09:22:43 INFO - Return code: 0 09:22: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')]} 09:22:43 INFO - https://queue.taskcluster.net/v1/task/UteF4m_nQPGrd8te-ixgUg/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 matches https://queue.taskcluster.net 09:22:43 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/UteF4m_nQPGrd8te-ixgUg/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 09:22:43 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/UteF4m_nQPGrd8te-ixgUg/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 09:22:43 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/UteF4m_nQPGrd8te-ixgUg/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 09:22:43 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/UteF4m_nQPGrd8te-ixgUg/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 09:22:45 INFO - Downloaded 57113385 bytes. 09:22:45 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/UteF4m_nQPGrd8te-ixgUg/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 09:22:45 INFO - mkdir: /builds/slave/test/properties 09:22:45 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 09:22:45 INFO - Writing to file /builds/slave/test/properties/build_url 09:22:45 INFO - Contents: 09:22:45 INFO - build_url:https://queue.taskcluster.net/v1/task/UteF4m_nQPGrd8te-ixgUg/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 09:22:45 INFO - Running post-action listener: _resource_record_post_action 09:22:45 INFO - Running post-action listener: set_extra_try_arguments 09:22:45 INFO - [mozharness: 2016-07-20 16:22:45.977850Z] Finished download-and-extract step (success) 09:22:45 INFO - [mozharness: 2016-07-20 16:22:45.978084Z] Running populate-webroot step. 09:22:45 INFO - Running pre-action listener: _resource_record_pre_action 09:22:45 INFO - Running main action method: populate_webroot 09:22:45 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 09:22:45 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 09:22:45 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 09:22:45 INFO - '--tppagecycles', 09:22:45 INFO - '7'], 09:22:45 INFO - 'tests': ['tsvgm']}}, 09:22:45 INFO - 'suites': {'chromez': {'talos_options': ['--disable-e10s'], 09:22:45 INFO - 'tests': ['tresize', 'tcanvasmark']}, 09:22:45 INFO - 'chromez-e10s': {'tests': ['tresize', 'tcanvasmark']}, 09:22:45 INFO - 'dromaeojs': {'talos_options': ['--disable-e10s'], 09:22:45 INFO - 'tests': ['dromaeo_css', 'kraken']}, 09:22:45 INFO - 'dromaeojs-e10s': {'tests': ['dromaeo_css', 'kraken']}, 09:22:45 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 09:22:45 INFO - 'talos_options': ['--disable-e10s'], 09:22:45 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 09:22:45 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 09:22:45 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 09:22:45 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 09:22:45 INFO - 'talos_options': ['--disable-e10s'], 09:22:45 INFO - 'tests': ['damp', 'tps']}, 09:22:45 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 09:22:45 INFO - 'tests': ['damp', 'tps']}, 09:22:45 INFO - 'g3': {'talos_options': ['--disable-e10s'], 09:22:45 INFO - 'tests': ['dromaeo_dom']}, 09:22:45 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 09:22:45 INFO - 'g4': {'talos_options': ['--disable-e10s'], 09:22:45 INFO - 'tests': ['basic_compositor_video']}, 09:22:45 INFO - 'g4-e10s': {'tests': ['basic_compositor_video']}, 09:22:45 INFO - 'other': {'talos_options': ['--disable-e10s'], 09:22:45 INFO - 'tests': ['a11yr', 09:22:45 INFO - 'ts_paint', 09:22:45 INFO - 'tpaint', 09:22:45 INFO - 'sessionrestore', 09:22:45 INFO - 'sessionrestore_no_auto_restore', 09:22:45 INFO - 'tabpaint']}, 09:22:45 INFO - 'other-e10s': {'tests': ['a11yr', 09:22:45 INFO - 'ts_paint', 09:22:45 INFO - 'tpaint', 09:22:45 INFO - 'sessionrestore', 09:22:45 INFO - 'sessionrestore_no_auto_restore', 09:22:45 INFO - 'tabpaint']}, 09:22:45 INFO - 'other-e10s_l64': {'tests': ['a11yr', 09:22:45 INFO - 'ts_paint', 09:22:45 INFO - 'tpaint', 09:22:45 INFO - 'sessionrestore', 09:22:45 INFO - 'sessionrestore_no_auto_restore', 09:22:45 INFO - 'tabpaint']}, 09:22:45 INFO - 'other-e10s_nol64': {'tests': ['a11yr', 09:22:45 INFO - 'ts_paint', 09:22:45 INFO - 'tpaint', 09:22:45 INFO - 'sessionrestore', 09:22:45 INFO - 'sessionrestore_no_auto_restore', 09:22:45 INFO - 'tabpaint']}, 09:22:45 INFO - 'other_l64': {'talos_options': ['--disable-e10s'], 09:22:45 INFO - 'tests': ['a11yr', 09:22:45 INFO - 'ts_paint', 09:22:45 INFO - 'tpaint', 09:22:45 INFO - 'sessionrestore', 09:22:45 INFO - 'sessionrestore_no_auto_restore', 09:22:45 INFO - 'tabpaint']}, 09:22:45 INFO - 'other_nol64': {'talos_options': ['--disable-e10s'], 09:22:45 INFO - 'tests': ['a11yr', 09:22:45 INFO - 'ts_paint', 09:22:45 INFO - 'tpaint', 09:22:45 INFO - 'sessionrestore', 09:22:45 INFO - 'sessionrestore_no_auto_restore', 09:22:45 INFO - 'tabpaint']}, 09:22:45 INFO - 'svgr': {'talos_options': ['--disable-e10s'], 09:22:45 INFO - 'tests': ['tsvgx', 09:22:45 INFO - 'tsvgr_opacity', 09:22:45 INFO - 'tart', 09:22:45 INFO - 'tscrollx', 09:22:45 INFO - 'cart']}, 09:22:45 INFO - 'svgr-e10s': {'tests': ['tsvgx', 09:22:45 INFO - 'tsvgr_opacity', 09:22:45 INFO - 'tart', 09:22:45 INFO - 'tscrollx', 09:22:45 INFO - 'cart']}, 09:22:45 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 09:22:45 INFO - 'talos_options': ['--disable-e10s'], 09:22:45 INFO - 'tests': ['tp5o']}, 09:22:45 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 09:22:45 INFO - 'tests': ['tp5o']}, 09:22:45 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 09:22:45 INFO - 'talos_options': ['--disable-e10s', 09:22:45 INFO - '--xperf_path', 09:22:45 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 09:22:45 INFO - 'tests': ['tp5n']}, 09:22:45 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 09:22:45 INFO - 'talos_options': ['--xperf_path', 09:22:45 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 09:22:45 INFO - 'tests': ['tp5n']}}, 09:22:45 INFO - 'talos.zip': {'path': '', 09:22:45 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 09:22:45 INFO - Running post-action listener: _resource_record_post_action 09:22:45 INFO - [mozharness: 2016-07-20 16:22:45.993633Z] Finished populate-webroot step (success) 09:22:45 INFO - [mozharness: 2016-07-20 16:22:45.993723Z] Running create-virtualenv step. 09:22:45 INFO - Running pre-action listener: _resource_record_pre_action 09:22:45 INFO - Running main action method: create_virtualenv 09:22:45 INFO - Creating virtualenv /builds/slave/test/build/venv 09:22:45 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 09:22:45 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 09:22:46 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 09:22:46 INFO - Using real prefix '/usr' 09:22:46 INFO - New python executable in /builds/slave/test/build/venv/bin/python 09:22:46 INFO - Installing distribute.............................................................................................................................................................................................done. 09:22:48 INFO - Installing pip.................done. 09:22:48 INFO - Return code: 0 09:22:48 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 09:22:48 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')]} 09:22:48 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 09:22:48 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 09:22:48 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')]} 09:22:48 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 09:22:48 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 09:22:48 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 0x102c030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x118f8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x125b400>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x12ea570>, '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 0x12eb470>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x12eb900>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': 'df17445c3590ff7897617a0e00000225-1469031754.342282-285633841', '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 09:22:48 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 09:22:48 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 09:22:48 INFO - Using env: {'DISPLAY': ':0', 09:22:48 INFO - 'HOME': '/home/cltbld', 09:22:48 INFO - 'LANG': 'en_US.UTF-8', 09:22:48 INFO - 'LANGUAGE': 'en_US:en', 09:22:48 INFO - 'LOGNAME': 'cltbld', 09:22:48 INFO - 'MAIL': '/var/mail/cltbld', 09:22:48 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 09:22:48 INFO - 'MOZ_NO_REMOTE': '1', 09:22:48 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 09:22:48 INFO - 'NO_EM_RESTART': '1', 09:22:48 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 09:22:48 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 09:22:48 INFO - 'PWD': '/builds/slave/test', 09:22:48 INFO - 'SHELL': '/bin/bash', 09:22:48 INFO - 'SHLVL': '1', 09:22:48 INFO - 'TERM': 'linux', 09:22:48 INFO - 'TMOUT': '86400', 09:22:48 INFO - 'USER': 'cltbld', 09:22:48 INFO - 'XDG_SESSION_COOKIE': 'df17445c3590ff7897617a0e00000225-1469031754.342282-285633841', 09:22:48 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 09:22:48 INFO - '_': '/tools/buildbot/bin/python'} 09:22:48 INFO - Ignoring indexes: https://pypi.python.org/simple/ 09:22:48 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 09:22:48 INFO - Cleaning up... 09:22:48 INFO - Return code: 0 09:22:48 INFO - Installing psutil>=3.1.1 into virtualenv /builds/slave/test/build/venv 09:22:48 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')]} 09:22:48 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 09:22:48 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 09:22:48 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')]} 09:22:48 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 09:22:48 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 09:22:48 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 0x102c030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x118f8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x125b400>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x12ea570>, '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 0x12eb470>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x12eb900>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': 'df17445c3590ff7897617a0e00000225-1469031754.342282-285633841', '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 09:22:48 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 09:22:48 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 09:22:48 INFO - Using env: {'DISPLAY': ':0', 09:22:48 INFO - 'HOME': '/home/cltbld', 09:22:48 INFO - 'LANG': 'en_US.UTF-8', 09:22:48 INFO - 'LANGUAGE': 'en_US:en', 09:22:48 INFO - 'LOGNAME': 'cltbld', 09:22:48 INFO - 'MAIL': '/var/mail/cltbld', 09:22:48 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 09:22:48 INFO - 'MOZ_NO_REMOTE': '1', 09:22:48 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 09:22:48 INFO - 'NO_EM_RESTART': '1', 09:22:48 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 09:22:48 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 09:22:48 INFO - 'PWD': '/builds/slave/test', 09:22:48 INFO - 'SHELL': '/bin/bash', 09:22:48 INFO - 'SHLVL': '1', 09:22:48 INFO - 'TERM': 'linux', 09:22:48 INFO - 'TMOUT': '86400', 09:22:48 INFO - 'USER': 'cltbld', 09:22:48 INFO - 'XDG_SESSION_COOKIE': 'df17445c3590ff7897617a0e00000225-1469031754.342282-285633841', 09:22:48 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 09:22:48 INFO - '_': '/tools/buildbot/bin/python'} 09:22:48 INFO - Ignoring indexes: https://pypi.python.org/simple/ 09:22:48 INFO - Downloading/unpacking psutil>=3.1.1 09:22: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 09:22: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 09:22: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 09:22: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 09:22: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 09:22: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 09:22:50 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 09:22:50 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 09:22:50 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 09:22:50 INFO - Installing collected packages: psutil 09:22:50 INFO - Running setup.py install for psutil 09:22:51 INFO - building 'psutil._psutil_linux' extension 09:22:51 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 09:22:51 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 09:22:51 INFO - building 'psutil._psutil_posix' extension 09:22:51 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 09:22:51 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 09:22:51 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 09:22:51 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 09:22:51 INFO - Successfully installed psutil 09:22:51 INFO - Cleaning up... 09:22:51 INFO - Return code: 0 09:22:51 INFO - Installing mozsystemmonitor==0.3 into virtualenv /builds/slave/test/build/venv 09:22: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')]} 09:22:51 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 09:22:51 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 09:22: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')]} 09:22:51 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 09:22:51 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 09:22: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', 'mozsystemmonitor==0.3']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x102c030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x118f8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x125b400>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x12ea570>, '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 0x12eb470>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x12eb900>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': 'df17445c3590ff7897617a0e00000225-1469031754.342282-285633841', '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 09:22: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', 'mozsystemmonitor==0.3'] in /builds/slave/test/build 09:22: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 mozsystemmonitor==0.3 09:22:51 INFO - Using env: {'DISPLAY': ':0', 09:22:51 INFO - 'HOME': '/home/cltbld', 09:22:51 INFO - 'LANG': 'en_US.UTF-8', 09:22:51 INFO - 'LANGUAGE': 'en_US:en', 09:22:51 INFO - 'LOGNAME': 'cltbld', 09:22:51 INFO - 'MAIL': '/var/mail/cltbld', 09:22:51 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 09:22:51 INFO - 'MOZ_NO_REMOTE': '1', 09:22:51 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 09:22:51 INFO - 'NO_EM_RESTART': '1', 09:22:51 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 09:22:51 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 09:22:51 INFO - 'PWD': '/builds/slave/test', 09:22:51 INFO - 'SHELL': '/bin/bash', 09:22:51 INFO - 'SHLVL': '1', 09:22:51 INFO - 'TERM': 'linux', 09:22:51 INFO - 'TMOUT': '86400', 09:22:51 INFO - 'USER': 'cltbld', 09:22:51 INFO - 'XDG_SESSION_COOKIE': 'df17445c3590ff7897617a0e00000225-1469031754.342282-285633841', 09:22:51 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 09:22:51 INFO - '_': '/tools/buildbot/bin/python'} 09:22:51 INFO - Ignoring indexes: https://pypi.python.org/simple/ 09:22:51 INFO - Downloading/unpacking mozsystemmonitor==0.3 09:22:51 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 09:22:51 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 09:22:51 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 09:22:51 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 09:22:51 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 09:22:51 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 09:22:53 INFO - Downloading mozsystemmonitor-0.3.tar.gz 09:22:53 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 09:22:53 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.3) 09:22:53 INFO - Installing collected packages: mozsystemmonitor 09:22:53 INFO - Running setup.py install for mozsystemmonitor 09:22:53 INFO - Successfully installed mozsystemmonitor 09:22:53 INFO - Cleaning up... 09:22:53 INFO - Return code: 0 09:22:53 INFO - Installing jsonschema==2.5.1 into virtualenv /builds/slave/test/build/venv 09:22:53 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 09:22:53 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 09:22:53 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 09:22:53 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 09:22:53 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 09:22:53 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 09:22:53 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', '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 0x102c030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x118f8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x125b400>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x12ea570>, '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 0x12eb470>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x12eb900>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': 'df17445c3590ff7897617a0e00000225-1469031754.342282-285633841', '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 09:22:53 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema==2.5.1'] in /builds/slave/test/build 09:22:53 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub jsonschema==2.5.1 09:22:53 INFO - Using env: {'DISPLAY': ':0', 09:22:53 INFO - 'HOME': '/home/cltbld', 09:22:53 INFO - 'LANG': 'en_US.UTF-8', 09:22:53 INFO - 'LANGUAGE': 'en_US:en', 09:22:53 INFO - 'LOGNAME': 'cltbld', 09:22:53 INFO - 'MAIL': '/var/mail/cltbld', 09:22:53 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 09:22:53 INFO - 'MOZ_NO_REMOTE': '1', 09:22:53 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 09:22:53 INFO - 'NO_EM_RESTART': '1', 09:22:53 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 09:22:53 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 09:22:53 INFO - 'PWD': '/builds/slave/test', 09:22:53 INFO - 'SHELL': '/bin/bash', 09:22:53 INFO - 'SHLVL': '1', 09:22:53 INFO - 'TERM': 'linux', 09:22:53 INFO - 'TMOUT': '86400', 09:22:53 INFO - 'USER': 'cltbld', 09:22:53 INFO - 'XDG_SESSION_COOKIE': 'df17445c3590ff7897617a0e00000225-1469031754.342282-285633841', 09:22:53 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 09:22:53 INFO - '_': '/tools/buildbot/bin/python'} 09:22:54 INFO - Ignoring indexes: https://pypi.python.org/simple/ 09:22:54 INFO - Downloading/unpacking jsonschema==2.5.1 09:22:54 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 09:22:54 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 09:22:54 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 09:22:54 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 09:22:54 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 09:22:54 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 09:22:55 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 09:22:55 INFO - Downloading/unpacking functools32 (from jsonschema==2.5.1) 09:22:55 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 09:22:55 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 09:22:55 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 09:22:55 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 09:22:55 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 09:22:55 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 09:22:56 INFO - Downloading functools32-3.2.3-2.tar.gz 09:22:56 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/functools32/setup.py) egg_info for package functools32 09:22:56 INFO - warning: no files found matching '*.txt' 09:22:56 INFO - no previously-included directories found matching 'build' 09:22:56 INFO - no previously-included directories found matching 'dist' 09:22:56 INFO - no previously-included directories found matching '.git*' 09:22:56 INFO - Installing collected packages: jsonschema, functools32 09:22:56 INFO - Running setup.py install for functools32 09:22:56 INFO - warning: no files found matching '*.txt' 09:22:56 INFO - no previously-included directories found matching 'build' 09:22:56 INFO - no previously-included directories found matching 'dist' 09:22:56 INFO - no previously-included directories found matching '.git*' 09:22:56 INFO - Successfully installed jsonschema functools32 09:22:56 INFO - Cleaning up... 09:22:56 INFO - Return code: 0 09:22:56 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 09:22:56 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 09:22:56 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 09:22:56 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 09:22:56 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 09:22:56 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 09:22:56 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 09:22:56 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', '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 0x102c030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x118f8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x125b400>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x12ea570>, '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 0x12eb470>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x12eb900>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': 'df17445c3590ff7897617a0e00000225-1469031754.342282-285633841', '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 09:22:56 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'blobuploader==1.2.4'] in /builds/slave/test/build 09:22:56 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub blobuploader==1.2.4 09:22:56 INFO - Using env: {'DISPLAY': ':0', 09:22:56 INFO - 'HOME': '/home/cltbld', 09:22:56 INFO - 'LANG': 'en_US.UTF-8', 09:22:56 INFO - 'LANGUAGE': 'en_US:en', 09:22:56 INFO - 'LOGNAME': 'cltbld', 09:22:56 INFO - 'MAIL': '/var/mail/cltbld', 09:22:56 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 09:22:56 INFO - 'MOZ_NO_REMOTE': '1', 09:22:56 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 09:22:56 INFO - 'NO_EM_RESTART': '1', 09:22:56 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 09:22:56 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 09:22:56 INFO - 'PWD': '/builds/slave/test', 09:22:56 INFO - 'SHELL': '/bin/bash', 09:22:56 INFO - 'SHLVL': '1', 09:22:56 INFO - 'TERM': 'linux', 09:22:56 INFO - 'TMOUT': '86400', 09:22:56 INFO - 'USER': 'cltbld', 09:22:56 INFO - 'XDG_SESSION_COOKIE': 'df17445c3590ff7897617a0e00000225-1469031754.342282-285633841', 09:22:56 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 09:22:56 INFO - '_': '/tools/buildbot/bin/python'} 09:22:56 INFO - Ignoring indexes: https://pypi.python.org/simple/ 09:22:56 INFO - Downloading/unpacking blobuploader==1.2.4 09:22:56 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 09:22:56 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 09:22:56 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 09:22:56 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 09:22:56 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 09:22:56 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 09:22:58 INFO - Downloading blobuploader-1.2.4.tar.gz 09:22:58 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 09:22:58 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 09:22:58 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 09:22:58 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 09:22:58 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 09:22:58 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 09:22:58 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 09:22:58 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 09:22:58 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 09:22:59 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 09:22:59 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 09:22:59 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 09:22:59 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 09:22:59 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 09:22:59 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 09:22:59 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 09:22:59 INFO - Downloading docopt-0.6.1.tar.gz 09:22:59 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 09:22:59 INFO - Installing collected packages: blobuploader, requests, docopt 09:22:59 INFO - Running setup.py install for blobuploader 09:22:59 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 09:22:59 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 09:22:59 INFO - Running setup.py install for requests 09:22:59 INFO - Running setup.py install for docopt 09:22:59 INFO - Successfully installed blobuploader requests docopt 09:22:59 INFO - Cleaning up... 09:22:59 INFO - Return code: 0 09:22:59 INFO - Installing None into virtualenv /builds/slave/test/build/venv 09:22:59 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 09:22:59 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 09:22:59 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 09:22:59 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 09:22:59 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 09:22:59 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 09:22:59 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 0x102c030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x118f8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x125b400>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x12ea570>, '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 0x12eb470>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x12eb900>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build/tests/config', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': 'df17445c3590ff7897617a0e00000225-1469031754.342282-285633841', '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 09:22:59 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 09:22:59 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 09:22:59 INFO - Using env: {'DISPLAY': ':0', 09:22:59 INFO - 'HOME': '/home/cltbld', 09:22:59 INFO - 'LANG': 'en_US.UTF-8', 09:22:59 INFO - 'LANGUAGE': 'en_US:en', 09:22:59 INFO - 'LOGNAME': 'cltbld', 09:22:59 INFO - 'MAIL': '/var/mail/cltbld', 09:22:59 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 09:22:59 INFO - 'MOZ_NO_REMOTE': '1', 09:22:59 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 09:22:59 INFO - 'NO_EM_RESTART': '1', 09:22:59 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 09:22:59 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 09:22:59 INFO - 'PWD': '/builds/slave/test', 09:22:59 INFO - 'SHELL': '/bin/bash', 09:22:59 INFO - 'SHLVL': '1', 09:22:59 INFO - 'TERM': 'linux', 09:22:59 INFO - 'TMOUT': '86400', 09:22:59 INFO - 'USER': 'cltbld', 09:22:59 INFO - 'XDG_SESSION_COOKIE': 'df17445c3590ff7897617a0e00000225-1469031754.342282-285633841', 09:22:59 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 09:22:59 INFO - '_': '/tools/buildbot/bin/python'} 09:23:00 INFO - Ignoring indexes: https://pypi.python.org/simple/ 09:23:00 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 09:23:00 INFO - Running setup.py (path:/tmp/pip-KBPDMk-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 09:23:00 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 09:23:00 INFO - Running setup.py (path:/tmp/pip-TXltcx-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 09:23:00 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 09:23:00 INFO - Running setup.py (path:/tmp/pip-3k0Y_6-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 09:23:00 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 09:23:00 INFO - Running setup.py (path:/tmp/pip-juwcXf-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 09:23:00 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 09:23:00 INFO - Running setup.py (path:/tmp/pip-sxJacB-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 09:23:00 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 09:23:00 INFO - Running setup.py (path:/tmp/pip-UrEcac-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 09:23:00 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 09:23:00 INFO - Running setup.py (path:/tmp/pip-s3yfdi-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 09:23:00 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 09:23:00 INFO - Running setup.py (path:/tmp/pip-qrYhto-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 09:23:00 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 09:23:00 INFO - Running setup.py (path:/tmp/pip-NAdpcR-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 09:23:00 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 09:23:00 INFO - Running setup.py (path:/tmp/pip-TBrK4Z-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 09:23:00 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 09:23:00 INFO - Running setup.py (path:/tmp/pip-1IR88b-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 09:23:00 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 09:23:00 INFO - Running setup.py (path:/tmp/pip-DUS5N3-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 09:23:01 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 09:23:01 INFO - Running setup.py (path:/tmp/pip-hEwx5w-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 09:23:01 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 09:23:01 INFO - Running setup.py (path:/tmp/pip-KT_6PP-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 09:23:01 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 09:23:01 INFO - Running setup.py (path:/tmp/pip-6yFrIe-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 09:23:01 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 09:23:01 INFO - Running setup.py (path:/tmp/pip-nBC8iQ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 09:23:01 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 09:23:01 INFO - Running setup.py (path:/tmp/pip-Lx4KwO-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 09:23:01 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 09:23:01 INFO - Running setup.py install for manifestparser 09:23:01 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 09:23:01 INFO - Running setup.py install for mozcrash 09:23:01 INFO - Running setup.py install for mozdebug 09:23:01 INFO - Running setup.py install for mozdevice 09:23:01 INFO - Installing sutini script to /builds/slave/test/build/venv/bin 09:23:01 INFO - Installing dm script to /builds/slave/test/build/venv/bin 09:23:01 INFO - Running setup.py install for mozfile 09:23:01 INFO - Running setup.py install for mozhttpd 09:23:01 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 09:23:01 INFO - Running setup.py install for mozinfo 09:23:02 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 09:23:02 INFO - Running setup.py install for mozInstall 09:23:02 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 09:23:02 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 09:23:02 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 09:23:02 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 09:23:02 INFO - Running setup.py install for mozleak 09:23:02 INFO - Running setup.py install for mozlog 09:23:02 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 09:23:02 INFO - Running setup.py install for moznetwork 09:23:02 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 09:23:02 INFO - Running setup.py install for mozprocess 09:23:02 INFO - Running setup.py install for mozprofile 09:23:02 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 09:23:02 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 09:23:02 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 09:23:02 INFO - Running setup.py install for mozrunner 09:23:02 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 09:23:02 INFO - Running setup.py install for mozscreenshot 09:23:02 INFO - Running setup.py install for moztest 09:23:03 INFO - Running setup.py install for mozversion 09:23:03 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 09:23:03 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 09:23:03 INFO - Cleaning up... 09:23:03 INFO - Return code: 0 09:23:03 INFO - Installing None into virtualenv /builds/slave/test/build/venv 09:23:03 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 09:23:03 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 09:23:03 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 09:23:03 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 09:23:03 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 09:23:03 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 09:23:03 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 0x102c030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x118f8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x125b400>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x12ea570>, '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 0x12eb470>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x12eb900>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build/tests/config', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': 'df17445c3590ff7897617a0e00000225-1469031754.342282-285633841', '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 09:23:03 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 09:23:03 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 09:23:03 INFO - Using env: {'DISPLAY': ':0', 09:23:03 INFO - 'HOME': '/home/cltbld', 09:23:03 INFO - 'LANG': 'en_US.UTF-8', 09:23:03 INFO - 'LANGUAGE': 'en_US:en', 09:23:03 INFO - 'LOGNAME': 'cltbld', 09:23:03 INFO - 'MAIL': '/var/mail/cltbld', 09:23:03 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 09:23:03 INFO - 'MOZ_NO_REMOTE': '1', 09:23:03 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 09:23:03 INFO - 'NO_EM_RESTART': '1', 09:23:03 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 09:23:03 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 09:23:03 INFO - 'PWD': '/builds/slave/test', 09:23:03 INFO - 'SHELL': '/bin/bash', 09:23:03 INFO - 'SHLVL': '1', 09:23:03 INFO - 'TERM': 'linux', 09:23:03 INFO - 'TMOUT': '86400', 09:23:03 INFO - 'USER': 'cltbld', 09:23:03 INFO - 'XDG_SESSION_COOKIE': 'df17445c3590ff7897617a0e00000225-1469031754.342282-285633841', 09:23:03 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 09:23:03 INFO - '_': '/tools/buildbot/bin/python'} 09:23:03 INFO - Ignoring indexes: https://pypi.python.org/simple/ 09:23:03 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 09:23:03 INFO - Running setup.py (path:/tmp/pip-Uw1Axu-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 09:23:03 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)) 09:23:03 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 09:23:03 INFO - Running setup.py (path:/tmp/pip-ZB2HSV-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 09:23:03 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)) 09:23:03 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 09:23:03 INFO - Running setup.py (path:/tmp/pip-f4Q7mr-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 09:23:03 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)) 09:23:03 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 09:23:03 INFO - Running setup.py (path:/tmp/pip-gCGBQx-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 09:23:03 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)) 09:23:03 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 09:23:03 INFO - Running setup.py (path:/tmp/pip-70l5WJ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 09:23:03 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)) 09:23:03 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 09:23:03 INFO - Running setup.py (path:/tmp/pip-f1QRdx-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 09:23:03 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)) 09:23:03 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 09:23:03 INFO - Running setup.py (path:/tmp/pip-19owX2-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 09:23:03 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)) 09:23:03 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 09:23:03 INFO - Running setup.py (path:/tmp/pip-QfPscY-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 09:23:03 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)) 09:23:03 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 09:23:03 INFO - Running setup.py (path:/tmp/pip-UNxVaQ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 09:23:04 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)) 09:23:04 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 09:23:04 INFO - Running setup.py (path:/tmp/pip-NiCi5Y-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 09:23:04 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog==3.3 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)) 09:23:04 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 09:23:04 INFO - Running setup.py (path:/tmp/pip-XPAaYo-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 09:23:04 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)) 09:23:04 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 09:23:04 INFO - Running setup.py (path:/tmp/pip-SMTbCB-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 09:23:04 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess==0.23 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)) 09:23:04 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 09:23:04 INFO - Running setup.py (path:/tmp/pip-iAw0Je-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 09:23:04 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)) 09:23:04 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 09:23:04 INFO - Running setup.py (path:/tmp/pip-VcViFK-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 09:23:04 INFO - Requirement already satisfied (use --upgrade to upgrade): mozrunner==6.12 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)) 09:23:04 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 09:23:04 INFO - Running setup.py (path:/tmp/pip-AAM21m-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 09:23:04 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)) 09:23:04 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 09:23:04 INFO - Running setup.py (path:/tmp/pip-1mXHoO-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 09:23:04 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)) 09:23:04 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 09:23:04 INFO - Running setup.py (path:/tmp/pip-1Y_3en-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 09:23:04 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)) 09:23:04 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)) 09:23:04 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)) 09:23:04 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)) 09:23:04 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)) 09:23:04 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)) 09:23:04 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.3->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 09:23:04 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 09:23:04 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 09:23:04 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 09:23:04 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 09:23:04 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 09:23:04 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 09:23:06 INFO - Downloading blessings-1.6.tar.gz 09:23:06 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 09:23:06 INFO - Installing collected packages: blessings 09:23:06 INFO - Running setup.py install for blessings 09:23:06 INFO - Successfully installed blessings 09:23:06 INFO - Cleaning up... 09:23:06 INFO - Return code: 0 09:23:06 INFO - Done creating virtualenv /builds/slave/test/build/venv. 09:23:06 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 09:23:06 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 09:23:06 INFO - Reading from file tmpfile_stdout 09:23:06 INFO - Current package versions: 09:23:06 INFO - argparse == 1.2.1 09:23:06 INFO - blessings == 1.6 09:23:06 INFO - blobuploader == 1.2.4 09:23:06 INFO - docopt == 0.6.1 09:23:06 INFO - functools32 == 3.2.3-2 09:23:06 INFO - jsonschema == 2.5.1 09:23:06 INFO - manifestparser == 1.1 09:23:06 INFO - mozInstall == 1.12 09:23:06 INFO - mozcrash == 0.17 09:23:06 INFO - mozdebug == 0.1 09:23:06 INFO - mozdevice == 0.48 09:23:06 INFO - mozfile == 1.2 09:23:06 INFO - mozhttpd == 0.7 09:23:06 INFO - mozinfo == 0.9 09:23:06 INFO - mozleak == 0.1 09:23:06 INFO - mozlog == 3.3 09:23:06 INFO - moznetwork == 0.27 09:23:06 INFO - mozprocess == 0.23 09:23:06 INFO - mozprofile == 0.28 09:23:06 INFO - mozrunner == 6.12 09:23:06 INFO - mozscreenshot == 0.1 09:23:06 INFO - mozsystemmonitor == 0.3 09:23:06 INFO - moztest == 0.7 09:23:06 INFO - mozversion == 1.4 09:23:06 INFO - psutil == 3.1.1 09:23:06 INFO - requests == 1.2.3 09:23:06 INFO - wsgiref == 0.1.2 09:23:06 INFO - Installing None into virtualenv /builds/slave/test/build/venv 09:23: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')]} 09:23:06 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 09:23:06 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 09:23: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')]} 09:23:06 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 09:23:06 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 09:23:06 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 0x102c030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x118f8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x125b400>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x12ea570>, '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 0x12eb470>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x12eb900>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build/tests/talos', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': 'df17445c3590ff7897617a0e00000225-1469031754.342282-285633841', '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 09:23:06 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 09:23:06 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 09:23:06 INFO - Using env: {'DISPLAY': ':0', 09:23:06 INFO - 'HOME': '/home/cltbld', 09:23:06 INFO - 'LANG': 'en_US.UTF-8', 09:23:06 INFO - 'LANGUAGE': 'en_US:en', 09:23:06 INFO - 'LOGNAME': 'cltbld', 09:23:06 INFO - 'MAIL': '/var/mail/cltbld', 09:23:06 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 09:23:06 INFO - 'MOZ_NO_REMOTE': '1', 09:23:06 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 09:23:06 INFO - 'NO_EM_RESTART': '1', 09:23:06 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 09:23:06 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 09:23:06 INFO - 'PWD': '/builds/slave/test', 09:23:06 INFO - 'SHELL': '/bin/bash', 09:23:06 INFO - 'SHLVL': '1', 09:23:06 INFO - 'TERM': 'linux', 09:23:06 INFO - 'TMOUT': '86400', 09:23:06 INFO - 'USER': 'cltbld', 09:23:06 INFO - 'XDG_SESSION_COOKIE': 'df17445c3590ff7897617a0e00000225-1469031754.342282-285633841', 09:23:06 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 09:23:06 INFO - '_': '/tools/buildbot/bin/python'} 09:23:07 INFO - Ignoring indexes: https://pypi.python.org/simple/ 09:23:07 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)) 09:23:07 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)) 09:23:07 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)) 09:23:07 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)) 09:23:07 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)) 09:23:07 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)) 09:23:07 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)) 09:23:07 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)) 09:23:07 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)) 09:23:07 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)) 09:23:07 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)) 09:23:07 INFO - Cleaning up... 09:23:07 INFO - Return code: 0 09:23:07 INFO - Installing jsonschema into virtualenv /builds/slave/test/build/venv 09:23:07 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')]} 09:23:07 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 09:23:07 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 09:23:07 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')]} 09:23:07 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 09:23:07 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 09:23:07 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 0x102c030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x118f8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x125b400>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x12ea570>, '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 0x12eb470>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x12eb900>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': 'df17445c3590ff7897617a0e00000225-1469031754.342282-285633841', '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 09:23:07 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 09:23:07 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 09:23:07 INFO - Using env: {'DISPLAY': ':0', 09:23:07 INFO - 'HOME': '/home/cltbld', 09:23:07 INFO - 'LANG': 'en_US.UTF-8', 09:23:07 INFO - 'LANGUAGE': 'en_US:en', 09:23:07 INFO - 'LOGNAME': 'cltbld', 09:23:07 INFO - 'MAIL': '/var/mail/cltbld', 09:23:07 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 09:23:07 INFO - 'MOZ_NO_REMOTE': '1', 09:23:07 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 09:23:07 INFO - 'NO_EM_RESTART': '1', 09:23:07 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 09:23:07 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 09:23:07 INFO - 'PWD': '/builds/slave/test', 09:23:07 INFO - 'SHELL': '/bin/bash', 09:23:07 INFO - 'SHLVL': '1', 09:23:07 INFO - 'TERM': 'linux', 09:23:07 INFO - 'TMOUT': '86400', 09:23:07 INFO - 'USER': 'cltbld', 09:23:07 INFO - 'XDG_SESSION_COOKIE': 'df17445c3590ff7897617a0e00000225-1469031754.342282-285633841', 09:23:07 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 09:23:07 INFO - '_': '/tools/buildbot/bin/python'} 09:23:07 INFO - Ignoring indexes: https://pypi.python.org/simple/ 09:23:07 INFO - Requirement already satisfied (use --upgrade to upgrade): jsonschema in ./venv/lib/python2.7/site-packages 09:23:07 INFO - Cleaning up... 09:23:07 INFO - Return code: 0 09:23:07 INFO - Running post-action listener: _resource_record_post_action 09:23:07 INFO - Running post-action listener: _start_resource_monitoring 09:23:07 INFO - Starting resource monitoring. 09:23:07 INFO - [mozharness: 2016-07-20 16:23:07.406244Z] Finished create-virtualenv step (success) 09:23:07 INFO - [mozharness: 2016-07-20 16:23:07.406726Z] Running install step. 09:23:07 INFO - Running pre-action listener: _resource_record_pre_action 09:23:07 INFO - Running main action method: install 09:23:07 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 09:23:07 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 09:23:07 INFO - Reading from file tmpfile_stdout 09:23:07 INFO - Detecting whether we're running mozinstall >=1.0... 09:23:07 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 09:23:07 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 09:23:07 INFO - Reading from file tmpfile_stdout 09:23:07 INFO - Output received: 09:23:07 INFO - Usage: mozinstall [options] installer 09:23:07 INFO - Options: 09:23:07 INFO - -h, --help show this help message and exit 09:23:07 INFO - -d DEST, --destination=DEST 09:23:07 INFO - Directory to install application into. [default: 09:23:07 INFO - "/builds/slave/test"] 09:23:07 INFO - --app=APP Application being installed. [default: firefox] 09:23:07 INFO - mkdir: /builds/slave/test/build/application 09:23:07 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'] 09:23:07 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 09:23:24 INFO - Reading from file tmpfile_stdout 09:23:24 INFO - Output received: 09:23:24 INFO - /builds/slave/test/build/application/firefox/firefox 09:23:24 INFO - Running post-action listener: _resource_record_post_action 09:23:24 INFO - [mozharness: 2016-07-20 16:23:24.073784Z] Finished install step (success) 09:23:24 INFO - [mozharness: 2016-07-20 16:23:24.074063Z] Running run-tests step. 09:23:24 INFO - Running pre-action listener: _resource_record_pre_action 09:23:24 INFO - Running main action method: run_tests 09:23:24 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 09:23:24 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 09:23:24 INFO - Python 2.7.3 09:23:24 INFO - Return code: 0 09:23:24 INFO - grabbing minidump binary from tooltool 09:23:24 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 09:23:24 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 0x12ea570>, '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 0x12eb470>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x12eb900>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 09:23:24 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 09:23:24 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 09:23:24 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 09:23:24 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 09:23:24 INFO - Return code: 0 09:23:24 INFO - Chmoding /builds/slave/test/build/linux64-minidump_stackwalk to 0755 09:23:24 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 09:23:24 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 09:23:24 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/linux64-minidump_stackwalk 09:23:24 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 09:23:24 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-e10s', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/UteF4m_nQPGrd8te-ixgUg/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-021', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log'] in /builds/slave/test/build 09:23:24 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-e10s --executablePath /builds/slave/test/build/application/firefox/firefox --symbolsPath https://queue.taskcluster.net/v1/task/UteF4m_nQPGrd8te-ixgUg/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.crashreporter-symbols.zip --title talos-linux64-ix-021 --webServer localhost --log-tbpl-level=debug --log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log --log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log 09:23:24 INFO - Using env: {'DISPLAY': ':0', 09:23:24 INFO - 'HOME': '/home/cltbld', 09:23:24 INFO - 'LANG': 'en_US.UTF-8', 09:23:24 INFO - 'LANGUAGE': 'en_US:en', 09:23:24 INFO - 'LOGNAME': 'cltbld', 09:23:24 INFO - 'MAIL': '/var/mail/cltbld', 09:23:24 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 09:23:24 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/linux64-minidump_stackwalk', 09:23:24 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 09:23:24 INFO - 'MOZ_NO_REMOTE': '1', 09:23:24 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 09:23:24 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 09:23:24 INFO - 'NO_EM_RESTART': '1', 09:23:24 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 09:23:24 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 09:23:24 INFO - 'PWD': '/builds/slave/test', 09:23:24 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 09:23:24 INFO - 'SHELL': '/bin/bash', 09:23:24 INFO - 'SHLVL': '1', 09:23:24 INFO - 'TERM': 'linux', 09:23:24 INFO - 'TMOUT': '86400', 09:23:24 INFO - 'USER': 'cltbld', 09:23:24 INFO - 'XDG_SESSION_COOKIE': 'df17445c3590ff7897617a0e00000225-1469031754.342282-285633841', 09:23:24 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 09:23:24 INFO - '_': '/tools/buildbot/bin/python'} 09:23:24 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-e10s', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/UteF4m_nQPGrd8te-ixgUg/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-021', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log'] with output_timeout 3600 09:23:24 INFO - mozversion application_buildid: 20160720075127 09:23:24 INFO - mozversion application_changeset: ee1973d27f13e5adc7d41a8917c097266ec907b7 09:23:24 INFO - mozversion application_display_name: Nightly 09:23:24 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 09:23:24 INFO - mozversion application_name: Firefox 09:23:24 INFO - mozversion application_remotingname: firefox 09:23:24 INFO - mozversion application_repository: https://hg.mozilla.org/mozilla-central 09:23:24 INFO - mozversion application_vendor: Mozilla 09:23:24 INFO - mozversion application_version: 50.0a1 09:23:24 INFO - mozversion platform_buildid: 20160720075127 09:23:24 INFO - mozversion platform_changeset: ee1973d27f13e5adc7d41a8917c097266ec907b7 09:23:24 INFO - mozversion platform_repository: https://hg.mozilla.org/mozilla-central 09:23:24 INFO - mozversion platform_version: 50.0a1 09:23:24 INFO - using testdate: 1469031804 09:23:24 INFO - actual date: 1469031804 09:23:24 INFO - starting webserver on 'localhost:39398' 09:23:24 INFO - SUITE-START | Running 2 tests 09:23:24 INFO - TEST-START | dromaeo_css 09:23:24 INFO - operating with platform_type : linux_ 09:23:24 INFO - Initialising browser for dromaeo_css test... 09:23:24 INFO - TEST-INFO | started process 1369 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpegL1in/profile http://localhost:39398/getInfo.html) 09:23:29 INFO - PROCESS | 1369 | __metrics Screen width/height:1600/1200 09:23:29 INFO - PROCESS | 1369 | colorDepth:24 09:23:29 INFO - PROCESS | 1369 | Browser inner width/height: 1024/697 09:23:29 INFO - PROCESS | 1369 | __metrics 09:23:30 ERROR - PROCESS | 1369 | JavaScript error: chrome://browser/content/tabbrowser.xml, line 2967: TypeError: this.tabs is undefined 09:23:31 INFO - TEST-INFO | 1369: exit 0 09:23:31 INFO - Browser initialized. 09:23:31 INFO - Running cycle 1/1 for dromaeo_css test... 09:23:31 INFO - TEST-INFO | started process 1491 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpegL1in/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 09:23:43 INFO - PROCESS | 1491 | RSS: Main: 168378368 09:23:43 INFO - PROCESS | 1491 | 09:24:32 INFO - PROCESS | 1491 | 1469031872764 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] 09:26:44 INFO - PROCESS | 1491 | Cycle 1(1): loaded http://localhost:39398/tests/dromaeo/cssquery-dojo.html (next: http://localhost:39398/tests/dromaeo/cssquery-ext.html) 09:26:46 INFO - PROCESS | 1491 | RSS: Main: 170274816 09:26:46 INFO - PROCESS | 1491 | 09:29:49 INFO - PROCESS | 1491 | Cycle 1(1): loaded http://localhost:39398/tests/dromaeo/cssquery-ext.html (next: http://localhost:39398/tests/dromaeo/cssquery-jquery.html) 09:29:50 INFO - PROCESS | 1491 | RSS: Main: 170344448 09:29:50 INFO - PROCESS | 1491 | 09:32:52 INFO - PROCESS | 1491 | Cycle 1(1): loaded http://localhost:39398/tests/dromaeo/cssquery-jquery.html (next: http://localhost:39398/tests/dromaeo/cssquery-mootools.html) 09:32:52 INFO - PROCESS | 1491 | RSS: Main: 173793280 09:32:52 INFO - PROCESS | 1491 | 09:35:54 INFO - PROCESS | 1491 | Cycle 1(1): loaded http://localhost:39398/tests/dromaeo/cssquery-mootools.html (next: http://localhost:39398/tests/dromaeo/cssquery-prototype.html) 09:35:55 INFO - PROCESS | 1491 | RSS: Main: 168095744 09:35:55 INFO - PROCESS | 1491 | 09:38:57 INFO - PROCESS | 1491 | Cycle 1(1): loaded http://localhost:39398/tests/dromaeo/cssquery-prototype.html (next: http://localhost:39398/tests/dromaeo/cssquery-yui.html) 09:38:58 INFO - PROCESS | 1491 | RSS: Main: 170221568 09:38:58 INFO - PROCESS | 1491 | 09:42:01 INFO - PROCESS | 1491 | Cycle 1(1): loaded http://localhost:39398/tests/dromaeo/cssquery-yui.html (next: http://localhost:39398/tests/dromaeo/cssquery-dojo.html) 09:42:01 INFO - PROCESS | 1491 | RSS: Main: 171270144 09:42:01 INFO - PROCESS | 1491 | 09:42:01 INFO - PROCESS | 1491 | __start_tp_report 09:42:01 INFO - PROCESS | 1491 | _x_x_mozilla_page_load 09:42:01 INFO - PROCESS | 1491 | _x_x_mozilla_page_load_details 09:42:01 INFO - PROCESS | 1491 | |i|pagename|runs| 09:42:01 INFO - PROCESS | 1491 | |0;dojo.html;2567.6148577713348;2609.1650671785023;2627.88174532146;2629.579267317231;2640.6039094135867;4715.999999999995;4741.549552792488;4795.712257264562;4805.807767689288;4826.10717017352;4691.648126390517;4699;4767.475577686451;4790.065937142259;4837.927431088537;4417.249067658506;4452;4551.886202844922;4578.107269082514;4589.5410458954175;4167.374893765929;4556.567126123013;4576.084783043388;4576.450825900896;4580.198465268565;4375.365571992075;4381.6494680425485;4427.358033085185;4452.554744525554;4493.505714371417;4418.094290670405;4438.955610443886;4462.330650402433;4519.615832654228;4562.703424277444;4463.062756821071;4477.037436951038;4480.5967462928165;4494.37078808967;4533.773311334453;4741.075490279397;4816.759162041884;4843.636727245435;4855.830045948375;4871.975640121812;5219.530242278213;5224.555912747421;5231.60762942777;5248.81629142982;5254.395744489394;5241.187615919501;5263.236830659571;5281.894362112775;5287.391949925769;5312.601554883399;4696.624270058422;4851.830185943475;4880.658353915192;4896.926546101811;4963.131451995886;5394.514493695508;5405.70268635221;5406.053940560465;5409.215663728737;5422.91865622016;5169.147090730063;5183.896322073613;5198.896022079537;5205.817796377109;5230.450802665741;4943.357363542788;4991.600671946236;5144.768485418165;5186.299849520266;5209.426963034063;5138.3577052868395;5179.1195496764885;5184.533391994739;5187.403448603383;5207.895842083137;5115.641905066684;5173.586113110942;5178.585713142939;5185.455527169668;5188.662736922088;4165.312723400605;4266.189424009428;4292.441982542312;4295.291276939332;4308.138372325548;3771.7925514096987;3783.981080094637;3787.6023017583307;3814.732968692165;3826.8469261229798;4457.9331310030375;4484;4491.124230774967;4521.073179998092;4522.050369422393;4971.577415919687;5183.585313174937;5221.921671174935;5223.2948551945;5247.606429517801;4481.843135490242;4494.550544945545;4499.392582001454;4515.75163366018;4534.546545345439;4653.232216684277;4660.533946605312;4666.2067448533835;4667.043256132485;4734.763261836894;4789.257665061921;4803.615710743202;4812.903741925212;4814.422269327703;4946.307516947558;5073.974630126826;5099.1841305392445;5100.872478188075;5111.284420181103;5150;4800.4479484859685;4829.154897892925;4834.7824347903725;4857.95142048575;4876.000419913838;4919.335889654851;4959.7272150032095;4962.801487940442;5030.547250747304;5035.521625445577;5095.108356037605;5115.15599926023;5123.692578445305;5140.023395554833;5161.122609156378;5036.823711170092;5047.545720885138;5050.368703912011;5051.04030234269;5088.771005304696;5008.198688209869;5035.244713293036;5041;5044.596432285482;5049.671771334852;4797.976010119927;4805.13507568641;4871.464138944784;4971.925421118758;4983.975080124576;5001.174806156943;5009.098362294676;5023.723695196653;5058.2918391425965;5064.569511591556;4918.1393256180745;4935.6051515877925;4955.776990035385;5002.224655178453;5005.949940500548 09:42:01 INFO - PROCESS | 1491 | |1;ext.html;562.4150883081595;562.8902364039013;571.7084287013622;579.3308728418676;591.2550186764676;35411.645883541154;39168.608313916855;39272.60727392725;39294.60705392945;39319.41020884689;40173.59826401735;40596.39105413421;40602.59397406025;40671;40789.184216315654;7686.846263074721;7874.055113386402;7882.290593846553;7883.408744344169;7888.368930485547;7549.207333230014;7574.091109066892;7647.235276472364;7654.387648988096;7662.501937374081;7622.428317876153;7639.541627502367;7643.541387516739;7647.61761911905;7665.118511371208;7581.772546823604;7587.544747315151;7619.4285428593075;7649.426293028045;7651.9234807651765;7611.80970475737;7614.162442131361;7675.2324767522805;7685.538867667958;7690;37997.24005519902;38029;38102;38139.23721525554;38196.80901595474;3213.951790723141;3230.660780618048;3259.4784834426378;3286.293446908926;3482.5472688550326;29581.852090739623;30067.398652027056;30107.69892301093;30246.54630180549;31082.844585776926;3348.162959260185;3359.7816141950693;3370.4775759757276;3392.423288041039;3423.7432192585406;250461;251327;252305;252307;253962;52941;53335.19997200045;53376;53398.46601533935;53452.465475345525;32165.839170803996;33819;34181.829090854386;35722.821385893425;35925.8203708985;14667.04664196845;14691.338889749773;14800.851991479947;14811.481598144013;14827.555173344817;11234.606788762354;11268.54925802975;11282.887171128348;11287.887121128848;11323.263987840764;18566.02943529029;18574;18636.627267454845;18666.906665466857;18678.34625788091;6557.213184396708;6986.510944233956;7029;7074.646267686698;7129.07514970955;798.6326289906708;859.0378775771052;917.5412293853074;936.5083331251147;951.6621599332276;27364.726352736616;28446.146615601567;28665.42669146647;29191.708082919326;29194.562081568794;927.6437847866349;1005.2912696548915;1029.1715169288793;1048.6224959014748;1068.1454836131063;13455.32723363828;13602.93198534001;13673.24797136167;13889.652758680912;14161;402700;403981;406283;406353;407123;49523;49535.25697114546;49768.25347619789;49933.50066499361;50081.74959125181;1171.1041053594008;1187.6971372300181;1206.4751832952518;1213.1083653514659;1216.9026477881748;26482.602760958216;27159.321016974733;27975.300617484725;28345.716542834307;28431.573526397533;43222.78388608037;43347.783261083496;43348.34977475403;43492.56507435012;43559.34660980025;277960;280240;280382;280992;281036;24386.756132438448;25491.745082548936;25675.614865776653;25941.740582594688;25946.74053259443;41969;42202;43425.56574434215;43515.56484435115;43900.341494878245;36364.454533181495;36785.81607091947;37137;37864.62135378721;37897.62102379051;36348.818255908554;37068.25863482661;37280.254394911404;37427;37901.988132195635;30757.384852303276;34780;35884.28231435409;36405.63594364023;36522.8173859129;30873.8456307726;33832.49251261184;33836.492452613726;33880;33954.15114622055;25269.87365063163;25756.61365079563;25863.22410327693;25873.353166170997;26198.86900565561 09:42:01 INFO - PROCESS | 1491 | |2;jquery.html;357.92662504186643;372.5213101165003;373.47340250247146;378.7462400191871;395.9030037640778;16783.41258055968;16824.831751682494;17491.212895419703;17581.648367032667;17586.912065439687;16319.673606527893;16840.83159168411;16998;17007.82992170078;17073.48779536616;5018.673786203894;5236.083685355066;5241.711705856176;5249.685018898859;5255.842324730264;3714.2014466889614;5187.922181167285;5816.389279125694;6093.573449858512;6155.353687862777;6194.318624951252;6195.81412557624;6212.130301757735;6217.59585626935;6223.346548612399;4977.203647416414;5224.085784987631;5267.1045922193125;5325.627206095575;5335.1730481775;5138.511841375063;5173.275741396207;5192.71440070796;5207.791688332462;5214.791408343662;18573.142685731455;19295.51761205981;19314.32399865998;20337.8983105085;20921.895390523103;1747.9825201747947;1803.2336257090815;1895.810418958107;1941.6602094633383;2533.050106210171;9210.355275130743;9355.345125841193;9454.33819632626;9778.559964801601;9826.75433114178;1661.335465813672;1685.907275099869;1691.957701057471;1702.421176799894;1766.5142085926345;62315.065274020926;68802;69053.65473172652;69599;72788;9966.551505182284;10204.846927296096;10359.171266298677;10488.213383996232;10557;14177.92911035459;14190.219537925306;14204.85795142056;14219.36012879423;14271.215083170526;7367.926320736831;7413.88879166813;7572.924270757222;7591.202923693043;7709.0749110107145;6975;7019.719211231493;7071.8939215911805;7241.058662373857;7247.601381924045;4333.263345231318;4360.084382279757;4433.756143412079;4448.421705178371;4520.615747661485;1547.1877264436262;1614.1203044340862;1629.7636842657748;1841.8710690251821;1898.9525261868287;802.5385403393072;826.8801023851628;833.5790425834914;862.1292494580518;921.589892497832;16427.753583696252;16501.33994640201;16536;17177.65644687099;17352.826471735374;848.8090179709516;858.978525536854;884.2351366068305;898.874157617934;916.1571354354011;8680.34897382699;9469.573869175903;9542.570584323723;9620.182284505896;9732.90267097334;418394;424737;429161;431313;437008;71666.64166679133;74057.25942740504;77864;84714;86735;885.57049830832;912.4114945860016;933.6405483888751;939.8919124300656;943.5093751249312;15560.221988900736;15665.138417387154;15914.840851591336;16116.194190290204;16572.917135414245;34436.311273773885;34463.82768086143;34813.82593087018;38122.237555249296;38671.41992870165;47801.521984781095;49092;50849.74575127101;51325.23012154896;51560.484395157066;7634.351080158027;7680.193579674054;7779.922200778146;7844.80387990282;7848.64681089341;11580.189386742848;11791.941040294743;11955.342456164646;12099.274043557414;12375.876241237473;10191.7452063699;10498.580056797642;10501;10765.784684306112;10860.891391086305;10153.136983356497;10393.58425662965;10477.37135771856;10546;10613.204009699459;10424.166066714493;10470.476476176313;10515.211359148247;10551.841722374324;11046.171537134907;7694.269044440769;7834.216578342121;7873.409494288066;7917.129115797143;8038.437309388287;7965.920340796518;10134.138598218939;10678.62624808128;10707.732306692395;10769.62306319275 09:42:01 INFO - PROCESS | 1491 | |3;mootools.html;1347.6832944258101;1395.6929475515385;1469.478335191007;1689.7127488326983;1705.7697210876536;6943.715412648664;7579.621018949058;7676.731314403997;8231.753047408572;8257.710980115697;7781.221877812216;7958.3633309335255;7983.281504664579;7991.840163196733;8003.479773814698;2178.1940681947704;2232.4195709115666;2245.247841972941;2246.48330883896;2246.7528571857083;2187.2781981946;2224.788645078723;2263.920762773303;2264.2188444986455;2264.445210923326;2216.512367279204;2221.4335344487213;2229.8550594211406;2232.8660280383147;2250.414892128042;2210.237468073512;2221.9666704999436;2223.7998580127864;2225.8219342452644;2232.7320721513524;2174.6629272462637;2179.8038176564187;2185.1805572910157;2185.8579192352445;2187.147012665062;8013.67945282188;8030;8040.035195776544;8054;8079.111297757242;4570.154521413516;4655.88360290992;4667.276572131325;4682.204025315705;4685.344051832746;2889.653241610999;2993.670696223414;3037.2862377341307;3038.0885734279627;3047.725704686589;914.5655813488606;970.4710932541782;973.4889183178817;1715.1938588863213;1800.9279628814832;10320.845187322197;10399.532021058994;10443.68668939933;10454.68635940923;10472.738181545446;3922.7450215735885;4077.368007958771;4141.834326626901;4169.541350451448;4174.165166966619;8319.376046796515;8327.250547450758;8356.665733370719;8381.916180838236;8402.957985210034;4579.381783459257;4623.283391074388;4629.305604159403;4638.976805115953;4647.6281897448125;3731.776093434403;4195.769232692171;4320.265554855682;4363.5418281080665;4366.803493842721;3380.7295416366633;3458.948115778265;3546;3566.5363502744476;3593.065802891267;1062.1715062251455;1072.104792498257;1074.6131392698621;1079.6868908016588;1086.147374311162;679.4089142446104;793.175097898191;794.7099308752264;796.1759578835993;826.0747962282162;4946.455889852114;5034.496550344937;5053.494650534991;5107.055194788976;5274.077036518671;409.76233784404974;416.40869964650267;423.45585922090584;425.17303844023075;430.7157276197757;3452.7583069185416;3525.8942231732576;3563.3585954527916;3568.7145028397667;3651.160233146338;9454.243660507143;9950.950245248872;9952.701418957442;9959.55182016811;9994.350367226107;9855.852162217572;9887.604495820087;9905.504724763732;9929.453880036523;9933.65232216869;7393.408527317802;7472;7516.24837516244;7522.322990930843;7542;5070.062038522885;5152.6650767699975;5162.767675454688;5216.087184742731;5236.10986132366;8834.867476987722;8856.64573417056;8944.418612790148;9002.684906028258;9052.094790520896;9040.502772347583;9174;9198.26413886874;9251.306152038758;9378.437293762396;5850.12248162779;6222.315545290105;6385.3295403983775;6439;6452.064450654722;7566.508176968479;7592.16486186508;7660.770176894702;7661.54030758134;7681.07827060734;6745.12313399255;6783.457323414016;6809.829754256183;6811.114555107804;6859.005444210661;6566.24488183865;6678.198616166092;6708.496862735216;6846.4522838173825;6901.516893817385;6073.757049718139;6143.324234334309;6151.231096112986;6158.876822463615;6181.443670069715;4173.561776013475;4226.2392769300595;4344.6089851913475;4398.362237475484;4476.9328460073775;4483.574060464251;4545.977270113761;4581.289900065495;4617.145828021827;4705.176594096088 09:42:01 INFO - PROCESS | 1491 | |4;prototype.html;298.26775266720205;299.1131295708225;306.23288661901944;309.2747507095861;309.54342345041056;5000.649954503187;5056.924146137811;5061.949380506194;5065.138926382515;5079.501547043622;4972.627052971024;4981.061173907394;4982.9252561211615;4983.931668357627;4986.803167239864;3696.611855755147;3844.942325865114;3910.452536644872;3951.486306780129;3965.583613720561;3935.4490371348033;3945.7237993340477;3958.2875082485143;3964.1278918637854;3966.9884179534324;3949.1509325495012;3953.8220780064967;3972.7020473464604;3988.441618173458;4003;3820.2550502651993;3934.8229329680235;3941.1723538056754;3976.383660532622;3988.8432354617125;3467.583889933199;3468.8785892493893;3469.60099588548;3472.73954453417;3509.1578021274963;4867.9269810952865;4870.561649451566;4879.170541008037;4905.141600219948;4918.213085906238;4396.296592545209;4525.683202175849;4532.235336444766;4539.818407263706;4554.817807287704;5205.96967182799;5206.453322401131;5222.556082732972;5223.817166399196;5282.7622756976025;3781.2248489059675;3789.9621003789885;3790.1851102013197;3816.8282427290837;3817.9045523862123;5401.352587460823;5522;5530.419305972895;5561.360443548962;5574;3822.694184465236;3872.9031774205305;3887.425592634931;3893.9415908761393;3908.4332771748504;3904.4924159859606;3934.4688467057154;3935.665468435158;3954.9604503955165;3967.603239676067;4467.932981005288;4480.865574032784;4482.731036137842;4498.527654596286;4503.707259028152;5111.284420181178;5236.607254455931;5257.185136303879;5262.815801447007;5275.973620131952;1354.6410201296665;1370.4312710225145;1375.21612680773;1375.5391943698974;1379.2689874366602;856.5631527920681;884.5754038061766;897.9371443998857;909.508865212791;914.3782228084833;4416.205083085076;4496.775161241925;4608.677392582554;4631;4634.513376095529;5425.457454254622;5473.31583552056;5492.725363731797;5494.5054945055135;5508.3114610673665;4473.910521789546;4628.773375055613;4634.165850146938;4660.277656963176;4692.483826779052;2893.450244453547;2899.1012786036395;2912.0244718019276;2917.810342327742;2931.8240905545736;5141;5180.394077835883;5214.687118772886;5215.087359712035;5218.295530103387;5408.323959505062;5490.450954904478;5544.22380866679;5573.303337082864;5578;5132.8964272680805;5141.100307446182;5154.329937108152;5157.948420515747;5164.715940623302;5426.240326354235;5451.48210919962;5464.644798088111;5475.75359108849;5498.780048798003;5050.84847454577;5287.603429742861;5291.3121294231505;5291.841244762663;5296.390915044665;5115.616328775282;5124.38507379102;5137.537621614073;5166.199239117943;5167.689938603696;3927.9018024549614;3943.881683549498;3957.8416863325147;3960.9009774755864;3973.2053589282837;5297.576193904555;5402.892407056623;5408.1617349309345;5430.266913966564;5504.366997795145;5222.616006758288;5239.47605239473;5243.8164664236565;5248.606354523502;5263.842084737464;5206.869828254324;5225.477452254744;5234.712090835041;5235.869103272448;5246.895062098813;4985.326980857682;5112.284280200701;5122.79508819658;5125.513076257749;5145.511176438233;4917.434495033117;5022.924656130088;5156.097682905552;5182.663126896739;5191.195364718475;5059.443461219189;5068.569171620454;5073.619478539198;5083.542481176712;5105.2086926526445 09:42:01 INFO - PROCESS | 1491 | |5;yui.html;567.7955935863089;586.1913870395358;598.8802239552091;626.9153664255325;730.5142080516457;13168.868311316885;13498.797518037238;13602.183868967868;13788.103773254745;13789.517366892149;13064;13154.210747355166;13302.667433314173;13342.399592018359;13355.53255636053;763.3435245688717;782.3037496628006;783.5377127494777;783.6786917363881;784.8587254294225;620.2866703291206;763.3015790551666;782.0615261685971;786.7128498098182;788.5544667262978;834.5284914023588;834.5410024486539;834.8413801377749;836.0427310729242;839.6977088248226;822.839546288474;824.488816933499;825.3644693585966;825.3727167352826;826.5784449930519;602.9879402411927;606.7633622887033;608.3612207182441;608.6256951974548;609.2871340531589;12582.622521324374;12593.685157871036;12597.118201725883;12604.495820167182;12649.114561980665;13421.86578134216;13667.589972300846;14121.929390353085;14300.92849535756;14559.053661512075;10402.739931501697;10550.577976880915;10608.045275925204;10645.520951557199;10801.891981080167;3389.559357283562;3394.389009978203;3397.456406974872;3402.574678165229;3425.0581090200394;62151.378486215464;63431;63851;63924.36075639277;64473;9866.605335786488;10097.646582369582;10228.48857557134;10327.535260913277;10459.267851250339;20397.592048158953;20464.59070818605;20635.380938571867;20644;20723.896380518;6420.903686444707;6475.449586785082;6534.967325163344;6715.1941766988275;6946.79159625212;3677.742558020913;3763.6048214937587;3784.848606055782;3793.791341476245;3812.370958791824;2887.812292201;2998.130542142754;3005.5341422079614;3006.9398612027635;3007.3985202959498;510.49206039990446;512.0859266209872;522.9869253268698;528.5005669642152;560.9074502707008;422.7315654559377;545.261171113136;550.119808306714;584.2988413903333;592.5407808948099;8156.184381561797;8490.350292822164;8618.482891026559;8665.35009874262;8690.130986901258;541.6506353402034;554.3347982421111;561.1078385367205;562.6624025584616;564.0495764636601;3742.856149793689;3915.4126880967515;3924.7252692311836;4076.30702780528;4090.877273681735;103685;103903;106689.4665526683;107104;108028;55553.72223138859;56416;89528.5523572378;90039;96439;62719;62803;63840;82531.93670158293;85056;8324.29243514284;8972.416792908702;9338.533073346169;9394.67118650844;9497.477638729937;43555.564444356416;44381.556184437744;44576.331355029055;45098.77450612726;47330.76334618305;63943.36056639374;68884;69230;69783;72172.27827721655;11616.535338586362;11875.109366797353;11879.928644899219;11957.342346171044;12295.016398688262;13428.597142085753;13506.459741610619;13659.521916732867;13877.306134693426;13914.234717090658;12681.112322137362;12685.365731713562;12848.164869283466;13079.476820927437;13456.5290214842;12748;12949.093563450844;13038.674033149247;13191.208527488381;13316.514013053611;12726.381316020395;12869.549565765154;13122.73754524885;13417.329133543479;13428.328583570978;10739.570417183226;10758.963308792585;10925.890741092488;11129.220954533104;11537.82693259585;10285.177185825265;10824.296420732628;10941.343519388862;11062.391568463812;11066.39134847591 09:42:01 INFO - PROCESS | 1491 | __end_tp_report 09:42:01 INFO - PROCESS | 1491 | __start_cc_report 09:42:01 INFO - PROCESS | 1491 | _x_x_mozilla_cycle_collect,407 09:42:01 INFO - PROCESS | 1491 | __end_cc_report 09:42:01 INFO - PROCESS | 1491 | __startTimestamp1469032921579__endTimestamp 09:42:01 INFO - PROCESS | 1491 | 09:42:01 INFO - PROCESS | 1491 | ------- Summary: start ------- 09:42:01 INFO - PROCESS | 1491 | Number of tests: 6 09:42:01 INFO - PROCESS | 1491 | 09:42:01 INFO - PROCESS | 1491 | [#0] dojo.html Cycles:165 Average:4774.81 Median:4871.98 stddev:516.50 (10.6%) stddev-sans-first:488.20 09:42:01 INFO - PROCESS | 1491 | Values: 2567.6 2609.2 2627.9 2629.6 2640.6 4716.0 4741.5 4795.7 4805.8 4826.1 4691.6 4699.0 4767.5 4790.1 4837.9 4417.2 4452.0 4551.9 4578.1 4589.5 4167.4 4556.6 4576.1 4576.5 4580.2 4375.4 4381.6 4427.4 4452.6 4493.5 4418.1 4439.0 4462.3 4519.6 4562.7 4463.1 4477.0 4480.6 4494.4 4533.8 4741.1 4816.8 4843.6 4855.8 4872.0 5219.5 5224.6 5231.6 5248.8 5254.4 5241.2 5263.2 5281.9 5287.4 5312.6 4696.6 4851.8 4880.7 4896.9 4963.1 5394.5 5405.7 5406.1 5409.2 5422.9 5169.1 5183.9 5198.9 5205.8 5230.5 4943.4 4991.6 5144.8 5186.3 5209.4 5138.4 5179.1 5184.5 5187.4 5207.9 5115.6 5173.6 5178.6 5185.5 5188.7 4165.3 4266.2 4292.4 4295.3 4308.1 3771.8 3784.0 3787.6 3814.7 3826.8 4457.9 4484.0 4491.1 4521.1 4522.1 4971.6 5183.6 5221.9 5223.3 5247.6 4481.8 4494.6 4499.4 4515.8 4534.5 4653.2 4660.5 4666.2 4667.0 4734.8 4789.3 4803.6 4812.9 4814.4 4946.3 5074.0 5099.2 5100.9 5111.3 5150.0 4800.4 4829.2 4834.8 4858.0 4876.0 4919.3 4959.7 4962.8 5030.5 5035.5 5095.1 5115.2 5123.7 5140.0 5161.1 5036.8 5047.5 5050.4 5051.0 5088.8 5008.2 5035.2 5041.0 5044.6 5049.7 4798.0 4805.1 4871.5 4971.9 4984.0 5001.2 5009.1 5023.7 5058.3 5064.6 4918.1 4935.6 4955.8 5002.2 5005.9 09:42:01 INFO - PROCESS | 1491 | 09:42:01 INFO - PROCESS | 1491 | [#1] ext.html Cycles:180 Average:46468.92 Median:36464.23 stddev:84150.54 (230.8%) stddev-sans-first:84316.01 09:42:01 INFO - PROCESS | 1491 | Values: 562.4 562.9 571.7 579.3 591.3 35411.6 39168.6 39272.6 39294.6 39319.4 40173.6 40596.4 40602.6 40671.0 40789.2 7686.8 7874.1 7882.3 7883.4 7888.4 7549.2 7574.1 7647.2 7654.4 7662.5 7622.4 7639.5 7643.5 7647.6 7665.1 7581.8 7587.5 7619.4 7649.4 7651.9 7611.8 7614.2 7675.2 7685.5 7690.0 37997.2 38029.0 38102.0 38139.2 38196.8 3214.0 3230.7 3259.5 3286.3 3482.5 29581.9 30067.4 30107.7 30246.5 31082.8 3348.2 3359.8 3370.5 3392.4 3423.7 250461.0 251327.0 252305.0 252307.0 253962.0 52941.0 53335.2 53376.0 53398.5 53452.5 32165.8 33819.0 34181.8 35722.8 35925.8 14667.0 14691.3 14800.9 14811.5 14827.6 11234.6 11268.5 11282.9 11287.9 11323.3 18566.0 18574.0 18636.6 18666.9 18678.3 6557.2 6986.5 7029.0 7074.6 7129.1 798.6 859.0 917.5 936.5 951.7 27364.7 28446.1 28665.4 29191.7 29194.6 927.6 1005.3 1029.2 1048.6 1068.1 13455.3 13602.9 13673.2 13889.7 14161.0 402700.0 403981.0 406283.0 406353.0 407123.0 49523.0 49535.3 49768.3 49933.5 50081.7 1171.1 1187.7 1206.5 1213.1 1216.9 26482.6 27159.3 27975.3 28345.7 28431.6 43222.8 43347.8 43348.3 43492.6 43559.3 277960.0 280240.0 280382.0 280992.0 281036.0 24386.8 25491.7 25675.6 25941.7 25946.7 41969.0 42202.0 43425.6 43515.6 43900.3 36364.5 36785.8 37137.0 37864.6 37897.6 36348.8 37068.3 37280.3 37427.0 37902.0 30757.4 34780.0 35884.3 36405.6 36522.8 30873.8 33832.5 33836.5 33880.0 33954.2 25269.9 25756.6 25863.2 25873.4 26198.9 09:42:01 INFO - PROCESS | 1491 | 09:42:01 INFO - PROCESS | 1491 | [#2] jquery.html Cycles:180 Average:25439.60 Median:220720.88 stddev:70476.91 (31.9%) stddev-sans-first:70649.45 09:42:01 INFO - PROCESS | 1491 | Values: 357.9 372.5 373.5 378.7 395.9 16783.4 16824.8 17491.2 17581.6 17586.9 16319.7 16840.8 16998.0 17007.8 17073.5 5018.7 5236.1 5241.7 5249.7 5255.8 3714.2 5187.9 5816.4 6093.6 6155.4 6194.3 6195.8 6212.1 6217.6 6223.3 4977.2 5224.1 5267.1 5325.6 5335.2 5138.5 5173.3 5192.7 5207.8 5214.8 18573.1 19295.5 19314.3 20337.9 20921.9 1748.0 1803.2 1895.8 1941.7 2533.1 9210.4 9355.3 9454.3 9778.6 9826.8 1661.3 1685.9 1692.0 1702.4 1766.5 62315.1 68802.0 69053.7 69599.0 72788.0 9966.6 10204.8 10359.2 10488.2 10557.0 14177.9 14190.2 14204.9 14219.4 14271.2 7367.9 7413.9 7572.9 7591.2 7709.1 6975.0 7019.7 7071.9 7241.1 7247.6 4333.3 4360.1 4433.8 4448.4 4520.6 1547.2 1614.1 1629.8 1841.9 1899.0 802.5 826.9 833.6 862.1 921.6 16427.8 16501.3 16536.0 17177.7 17352.8 848.8 859.0 884.2 898.9 916.2 8680.3 9469.6 9542.6 9620.2 9732.9 418394.0 424737.0 429161.0 431313.0 437008.0 71666.6 74057.3 77864.0 84714.0 86735.0 885.6 912.4 933.6 939.9 943.5 15560.2 15665.1 15914.8 16116.2 16572.9 34436.3 34463.8 34813.8 38122.2 38671.4 47801.5 49092.0 50849.7 51325.2 51560.5 7634.4 7680.2 7779.9 7844.8 7848.6 11580.2 11791.9 11955.3 12099.3 12375.9 10191.7 10498.6 10501.0 10765.8 10860.9 10153.1 10393.6 10477.4 10546.0 10613.2 10424.2 10470.5 10515.2 10551.8 11046.2 7694.3 7834.2 7873.4 7917.1 8038.4 7965.9 10134.1 10678.6 10707.7 10769.6 09:42:01 INFO - PROCESS | 1491 | 09:42:01 INFO - PROCESS | 1491 | [#3] mootools.html Cycles:180 Average:5123.80 Median:4695.26 stddev:2889.38 (61.5%) stddev-sans-first:2883.56 09:42:01 INFO - PROCESS | 1491 | Values: 1347.7 1395.7 1469.5 1689.7 1705.8 6943.7 7579.6 7676.7 8231.8 8257.7 7781.2 7958.4 7983.3 7991.8 8003.5 2178.2 2232.4 2245.2 2246.5 2246.8 2187.3 2224.8 2263.9 2264.2 2264.4 2216.5 2221.4 2229.9 2232.9 2250.4 2210.2 2222.0 2223.8 2225.8 2232.7 2174.7 2179.8 2185.2 2185.9 2187.1 8013.7 8030.0 8040.0 8054.0 8079.1 4570.2 4655.9 4667.3 4682.2 4685.3 2889.7 2993.7 3037.3 3038.1 3047.7 914.6 970.5 973.5 1715.2 1800.9 10320.8 10399.5 10443.7 10454.7 10472.7 3922.7 4077.4 4141.8 4169.5 4174.2 8319.4 8327.3 8356.7 8381.9 8403.0 4579.4 4623.3 4629.3 4639.0 4647.6 3731.8 4195.8 4320.3 4363.5 4366.8 3380.7 3458.9 3546.0 3566.5 3593.1 1062.2 1072.1 1074.6 1079.7 1086.1 679.4 793.2 794.7 796.2 826.1 4946.5 5034.5 5053.5 5107.1 5274.1 409.8 416.4 423.5 425.2 430.7 3452.8 3525.9 3563.4 3568.7 3651.2 9454.2 9951.0 9952.7 9959.6 9994.4 9855.9 9887.6 9905.5 9929.5 9933.7 7393.4 7472.0 7516.2 7522.3 7542.0 5070.1 5152.7 5162.8 5216.1 5236.1 8834.9 8856.6 8944.4 9002.7 9052.1 9040.5 9174.0 9198.3 9251.3 9378.4 5850.1 6222.3 6385.3 6439.0 6452.1 7566.5 7592.2 7660.8 7661.5 7681.1 6745.1 6783.5 6809.8 6811.1 6859.0 6566.2 6678.2 6708.5 6846.5 6901.5 6073.8 6143.3 6151.2 6158.9 6181.4 4173.6 4226.2 4344.6 4398.4 4476.9 4483.6 4546.0 4581.3 4617.1 4705.2 09:42:01 INFO - PROCESS | 1491 | 09:42:01 INFO - PROCESS | 1491 | [#4] prototype.html Cycles:180 Average:4379.77 Median:4986.07 stddev:1260.39 (25.3%) stddev-sans-first:1226.13 09:42:01 INFO - PROCESS | 1491 | Values: 298.3 299.1 306.2 309.3 309.5 5000.6 5056.9 5061.9 5065.1 5079.5 4972.6 4981.1 4982.9 4983.9 4986.8 3696.6 3844.9 3910.5 3951.5 3965.6 3935.4 3945.7 3958.3 3964.1 3967.0 3949.2 3953.8 3972.7 3988.4 4003.0 3820.3 3934.8 3941.2 3976.4 3988.8 3467.6 3468.9 3469.6 3472.7 3509.2 4867.9 4870.6 4879.2 4905.1 4918.2 4396.3 4525.7 4532.2 4539.8 4554.8 5206.0 5206.5 5222.6 5223.8 5282.8 3781.2 3790.0 3790.2 3816.8 3817.9 5401.4 5522.0 5530.4 5561.4 5574.0 3822.7 3872.9 3887.4 3893.9 3908.4 3904.5 3934.5 3935.7 3955.0 3967.6 4467.9 4480.9 4482.7 4498.5 4503.7 5111.3 5236.6 5257.2 5262.8 5276.0 1354.6 1370.4 1375.2 1375.5 1379.3 856.6 884.6 897.9 909.5 914.4 4416.2 4496.8 4608.7 4631.0 4634.5 5425.5 5473.3 5492.7 5494.5 5508.3 4473.9 4628.8 4634.2 4660.3 4692.5 2893.5 2899.1 2912.0 2917.8 2931.8 5141.0 5180.4 5214.7 5215.1 5218.3 5408.3 5490.5 5544.2 5573.3 5578.0 5132.9 5141.1 5154.3 5157.9 5164.7 5426.2 5451.5 5464.6 5475.8 5498.8 5050.8 5287.6 5291.3 5291.8 5296.4 5115.6 5124.4 5137.5 5166.2 5167.7 3927.9 3943.9 3957.8 3960.9 3973.2 5297.6 5402.9 5408.2 5430.3 5504.4 5222.6 5239.5 5243.8 5248.6 5263.8 5206.9 5225.5 5234.7 5235.9 5246.9 4985.3 5112.3 5122.8 5125.5 5145.5 4917.4 5022.9 5156.1 5182.7 5191.2 5059.4 5068.6 5073.6 5083.5 5105.2 09:42:01 INFO - PROCESS | 1491 | 09:42:01 INFO - PROCESS | 1491 | [#5] yui.html Cycles:180 Average:18277.34 Median:3920.07 stddev:26011.02 (663.5%) stddev-sans-first:26049.99 09:42:01 INFO - PROCESS | 1491 | Values: 567.8 586.2 598.9 626.9 730.5 13168.9 13498.8 13602.2 13788.1 13789.5 13064.0 13154.2 13302.7 13342.4 13355.5 763.3 782.3 783.5 783.7 784.9 620.3 763.3 782.1 786.7 788.6 834.5 834.5 834.8 836.0 839.7 822.8 824.5 825.4 825.4 826.6 603.0 606.8 608.4 608.6 609.3 12582.6 12593.7 12597.1 12604.5 12649.1 13421.9 13667.6 14121.9 14300.9 14559.1 10402.7 10550.6 10608.0 10645.5 10801.9 3389.6 3394.4 3397.5 3402.6 3425.1 62151.4 63431.0 63851.0 63924.4 64473.0 9866.6 10097.6 10228.5 10327.5 10459.3 20397.6 20464.6 20635.4 20644.0 20723.9 6420.9 6475.4 6535.0 6715.2 6946.8 3677.7 3763.6 3784.8 3793.8 3812.4 2887.8 2998.1 3005.5 3006.9 3007.4 510.5 512.1 523.0 528.5 560.9 422.7 545.3 550.1 584.3 592.5 8156.2 8490.4 8618.5 8665.4 8690.1 541.7 554.3 561.1 562.7 564.0 3742.9 3915.4 3924.7 4076.3 4090.9 103685.0 103903.0 106689.5 107104.0 108028.0 55553.7 56416.0 89528.6 90039.0 96439.0 62719.0 62803.0 63840.0 82531.9 85056.0 8324.3 8972.4 9338.5 9394.7 9497.5 43555.6 44381.6 44576.3 45098.8 47330.8 63943.4 68884.0 69230.0 69783.0 72172.3 11616.5 11875.1 11879.9 11957.3 12295.0 13428.6 13506.5 13659.5 13877.3 13914.2 12681.1 12685.4 12848.2 13079.5 13456.5 12748.0 12949.1 13038.7 13191.2 13316.5 12726.4 12869.5 13122.7 13417.3 13428.3 10739.6 10759.0 10925.9 11129.2 11537.8 10285.2 10824.3 10941.3 11062.4 11066.4 09:42:01 INFO - PROCESS | 1491 | -------- Summary: end -------- 09:42:01 INFO - PROCESS | 1491 | 09:42:02 INFO - TEST-INFO | 1491: exit 0 09:42:02 INFO - TEST-OK | dromaeo_css | took 1118048ms 09:42:02 INFO - TEST-START | kraken 09:42:02 INFO - operating with platform_type : linux_ 09:42:02 INFO - Initialising browser for kraken test... 09:42:02 INFO - TEST-INFO | started process 1734 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpi6MdmX/profile http://localhost:39398/getInfo.html) 09:42:07 INFO - PROCESS | 1734 | __metrics Screen width/height:1600/1200 09:42:07 INFO - PROCESS | 1734 | colorDepth:24 09:42:07 INFO - PROCESS | 1734 | Browser inner width/height: 1024/697 09:42:07 INFO - PROCESS | 1734 | __metrics 09:42:08 ERROR - PROCESS | 1734 | JavaScript error: chrome://browser/content/tabbrowser.xml, line 2967: TypeError: this.tabs is undefined 09:42:09 INFO - TEST-INFO | 1734: exit 0 09:42:09 INFO - Browser initialized. 09:42:09 INFO - Running cycle 1/1 for kraken test... 09:42:09 INFO - TEST-INFO | started process 1855 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpi6MdmX/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 09:42:21 INFO - PROCESS | 1855 | RSS: Main: 168701952 09:42:21 INFO - PROCESS | 1855 | 09:42:23 INFO - PROCESS | 1855 | Cycle 1(1): loaded http://localhost:39398/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:39398/tests/kraken/driver.html?testName=audio-beat-detection) 09:42:24 INFO - PROCESS | 1855 | RSS: Main: 173641728 09:42:24 INFO - PROCESS | 1855 | 09:42:27 INFO - PROCESS | 1855 | Cycle 1(1): loaded http://localhost:39398/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:39398/tests/kraken/driver.html?testName=audio-dft) 09:42:28 INFO - PROCESS | 1855 | RSS: Main: 172986368 09:42:28 INFO - PROCESS | 1855 | 09:42:31 INFO - PROCESS | 1855 | Cycle 1(1): loaded http://localhost:39398/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:39398/tests/kraken/driver.html?testName=audio-fft) 09:42:31 INFO - PROCESS | 1855 | RSS: Main: 169181184 09:42:31 INFO - PROCESS | 1855 | 09:42:34 INFO - PROCESS | 1855 | Cycle 1(1): loaded http://localhost:39398/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:39398/tests/kraken/driver.html?testName=audio-oscillator) 09:42:34 INFO - PROCESS | 1855 | RSS: Main: 169635840 09:42:34 INFO - PROCESS | 1855 | 09:42:36 INFO - PROCESS | 1855 | Cycle 1(1): loaded http://localhost:39398/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:39398/tests/kraken/driver.html?testName=imaging-gaussian-blur) 09:42:37 INFO - PROCESS | 1855 | RSS: Main: 170151936 09:42:37 INFO - PROCESS | 1855 | 09:42:40 INFO - PROCESS | 1855 | Cycle 1(1): loaded http://localhost:39398/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:39398/tests/kraken/driver.html?testName=imaging-darkroom) 09:42:41 INFO - PROCESS | 1855 | RSS: Main: 170377216 09:42:41 INFO - PROCESS | 1855 | 09:42:45 INFO - PROCESS | 1855 | Cycle 1(1): loaded http://localhost:39398/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:39398/tests/kraken/driver.html?testName=imaging-desaturate) 09:42:45 INFO - PROCESS | 1855 | RSS: Main: 167821312 09:42:45 INFO - PROCESS | 1855 | 09:42:48 INFO - PROCESS | 1855 | Cycle 1(1): loaded http://localhost:39398/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:39398/tests/kraken/driver.html?testName=json-parse-financial) 09:42:49 INFO - PROCESS | 1855 | RSS: Main: 169209856 09:42:49 INFO - PROCESS | 1855 | 09:42:50 INFO - PROCESS | 1855 | Cycle 1(1): loaded http://localhost:39398/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:39398/tests/kraken/driver.html?testName=json-stringify-tinderbox) 09:42:51 INFO - PROCESS | 1855 | RSS: Main: 169598976 09:42:51 INFO - PROCESS | 1855 | 09:42:53 INFO - PROCESS | 1855 | Cycle 1(1): loaded http://localhost:39398/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:39398/tests/kraken/driver.html?testName=stanford-crypto-aes) 09:42:54 INFO - PROCESS | 1855 | RSS: Main: 169734144 09:42:54 INFO - PROCESS | 1855 | 09:42:56 INFO - PROCESS | 1855 | Cycle 1(1): loaded http://localhost:39398/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:39398/tests/kraken/driver.html?testName=stanford-crypto-ccm) 09:42:57 INFO - PROCESS | 1855 | RSS: Main: 170135552 09:42:57 INFO - PROCESS | 1855 | 09:42:59 INFO - PROCESS | 1855 | Cycle 1(1): loaded http://localhost:39398/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:39398/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 09:43:00 INFO - PROCESS | 1855 | RSS: Main: 170233856 09:43:00 INFO - PROCESS | 1855 | 09:43:03 INFO - PROCESS | 1855 | Cycle 1(1): loaded http://localhost:39398/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:39398/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 09:43:03 INFO - PROCESS | 1855 | RSS: Main: 170012672 09:43:03 INFO - PROCESS | 1855 | 09:43:05 INFO - PROCESS | 1855 | Cycle 1(1): loaded http://localhost:39398/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:39398/tests/kraken/driver.html?testName=ai-astar) 09:43:05 INFO - PROCESS | 1855 | RSS: Main: 171012096 09:43:05 INFO - PROCESS | 1855 | 09:43:05 INFO - PROCESS | 1855 | __start_tp_report 09:43:05 INFO - PROCESS | 1855 | _x_x_mozilla_page_load 09:43:05 INFO - PROCESS | 1855 | _x_x_mozilla_page_load_details 09:43:05 INFO - PROCESS | 1855 | |i|pagename|runs| 09:43:05 INFO - PROCESS | 1855 | |0;ai-astar;104;115;108;115;116;114;116;114;114;114 09:43:05 INFO - PROCESS | 1855 | |1;audio-beat-detection;161;126;145;180;124;151;151;125;191;133 09:43:05 INFO - PROCESS | 1855 | |2;audio-dft;165;164;165;168;171;165;164;163;164;163 09:43:05 INFO - PROCESS | 1855 | |3;audio-fft;76;77;80;151;78;76;76;76;160;77 09:43:05 INFO - PROCESS | 1855 | |4;audio-oscillator;86;85;161;86;86;85;138;85;86;144 09:43:05 INFO - PROCESS | 1855 | |5;imaging-gaussian-blur;117;117;118;118;118;123;119;119;119;117 09:43:05 INFO - PROCESS | 1855 | |6;imaging-darkroom;149;148;148;148;147;148;148;148;147;147 09:43:05 INFO - PROCESS | 1855 | |7;imaging-desaturate;96;96;100;97;95;96;97;96;96;95 09:43:05 INFO - PROCESS | 1855 | |8;json-parse-financial;64;64;63;64;63;63;65;63;62;64 09:43:05 INFO - PROCESS | 1855 | |9;json-stringify-tinderbox;66;67;66;66;67;67;66;67;68;67 09:43:05 INFO - PROCESS | 1855 | |10;stanford-crypto-aes;89;81;80;81;80;80;80;80;83;78 09:43:05 INFO - PROCESS | 1855 | |11;stanford-crypto-ccm;131;132;138;132;148;131;147;130;169;142 09:43:05 INFO - PROCESS | 1855 | |12;stanford-crypto-pbkdf2;169;166;165;169;164;164;164;167;170;169 09:43:05 INFO - PROCESS | 1855 | |13;stanford-crypto-sha256-iterative;74;68;68;69;68;67;67;67;67;66 09:43:05 INFO - PROCESS | 1855 | __end_tp_report 09:43:06 INFO - PROCESS | 1855 | __start_cc_report 09:43:06 INFO - PROCESS | 1855 | _x_x_mozilla_cycle_collect,999 09:43:06 INFO - PROCESS | 1855 | __end_cc_report 09:43:06 INFO - PROCESS | 1855 | __startTimestamp1469032985990__endTimestamp 09:43:06 INFO - PROCESS | 1855 | 09:43:06 INFO - PROCESS | 1855 | ------- Summary: start ------- 09:43:06 INFO - PROCESS | 1855 | Number of tests: 14 09:43:06 INFO - PROCESS | 1855 | 09:43:06 INFO - PROCESS | 1855 | [#0] ai-astar Cycles:10 Average:113.00 Median:114.50 stddev:3.89 (3.4%) stddev-sans-first:2.40 09:43:06 INFO - PROCESS | 1855 | Values: 104.0 115.0 108.0 115.0 116.0 114.0 116.0 114.0 114.0 114.0 09:43:06 INFO - PROCESS | 1855 | 09:43:06 INFO - PROCESS | 1855 | [#1] audio-beat-detection Cycles:10 Average:148.70 Median:151.00 stddev:23.28 (15.4%) stddev-sans-first:24.26 09:43:06 INFO - PROCESS | 1855 | Values: 161.0 126.0 145.0 180.0 124.0 151.0 151.0 125.0 191.0 133.0 09:43:06 INFO - PROCESS | 1855 | 09:43:06 INFO - PROCESS | 1855 | [#2] audio-dft Cycles:10 Average:165.20 Median:165.00 stddev:2.49 (1.5%) stddev-sans-first:2.64 09:43:06 INFO - PROCESS | 1855 | Values: 165.0 164.0 165.0 168.0 171.0 165.0 164.0 163.0 164.0 163.0 09:43:06 INFO - PROCESS | 1855 | 09:43:06 INFO - PROCESS | 1855 | [#3] audio-fft Cycles:10 Average:92.70 Median:76.50 stddev:33.19 (43.4%) stddev-sans-first:34.65 09:43:06 INFO - PROCESS | 1855 | Values: 76.0 77.0 80.0 151.0 78.0 76.0 76.0 76.0 160.0 77.0 09:43:06 INFO - PROCESS | 1855 | 09:43:06 INFO - PROCESS | 1855 | [#4] audio-oscillator Cycles:10 Average:104.20 Median:85.50 stddev:30.52 (35.7%) stddev-sans-first:31.65 09:43:06 INFO - PROCESS | 1855 | Values: 86.0 85.0 161.0 86.0 86.0 85.0 138.0 85.0 86.0 144.0 09:43:06 INFO - PROCESS | 1855 | 09:43:06 INFO - PROCESS | 1855 | [#5] imaging-gaussian-blur Cycles:10 Average:118.50 Median:118.50 stddev:1.78 (1.5%) stddev-sans-first:1.80 09:43:06 INFO - PROCESS | 1855 | Values: 117.0 117.0 118.0 118.0 118.0 123.0 119.0 119.0 119.0 117.0 09:43:06 INFO - PROCESS | 1855 | 09:43:06 INFO - PROCESS | 1855 | [#6] imaging-darkroom Cycles:10 Average:147.80 Median:148.00 stddev:0.63 (0.4%) stddev-sans-first:0.50 09:43:06 INFO - PROCESS | 1855 | Values: 149.0 148.0 148.0 148.0 147.0 148.0 148.0 148.0 147.0 147.0 09:43:06 INFO - PROCESS | 1855 | 09:43:06 INFO - PROCESS | 1855 | [#7] imaging-desaturate Cycles:10 Average:96.40 Median:96.00 stddev:1.43 (1.5%) stddev-sans-first:1.51 09:43:06 INFO - PROCESS | 1855 | Values: 96.0 96.0 100.0 97.0 95.0 96.0 97.0 96.0 96.0 95.0 09:43:06 INFO - PROCESS | 1855 | 09:43:06 INFO - PROCESS | 1855 | [#8] json-parse-financial Cycles:10 Average:63.50 Median:64.00 stddev:0.85 (1.3%) stddev-sans-first:0.88 09:43:06 INFO - PROCESS | 1855 | Values: 64.0 64.0 63.0 64.0 63.0 63.0 65.0 63.0 62.0 64.0 09:43:06 INFO - PROCESS | 1855 | 09:43:06 INFO - PROCESS | 1855 | [#9] json-stringify-tinderbox Cycles:10 Average:66.70 Median:67.00 stddev:0.67 (1.0%) stddev-sans-first:0.67 09:43:06 INFO - PROCESS | 1855 | Values: 66.0 67.0 66.0 66.0 67.0 67.0 66.0 67.0 68.0 67.0 09:43:06 INFO - PROCESS | 1855 | 09:43:06 INFO - PROCESS | 1855 | [#10] stanford-crypto-aes Cycles:10 Average:81.20 Median:80.50 stddev:3.01 (3.7%) stddev-sans-first:1.32 09:43:06 INFO - PROCESS | 1855 | Values: 89.0 81.0 80.0 81.0 80.0 80.0 80.0 80.0 83.0 78.0 09:43:06 INFO - PROCESS | 1855 | 09:43:06 INFO - PROCESS | 1855 | [#11] stanford-crypto-ccm Cycles:10 Average:140.00 Median:140.00 stddev:12.26 (8.8%) stddev-sans-first:12.56 09:43:06 INFO - PROCESS | 1855 | Values: 131.0 132.0 138.0 132.0 148.0 131.0 147.0 130.0 169.0 142.0 09:43:06 INFO - PROCESS | 1855 | 09:43:06 INFO - PROCESS | 1855 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:166.70 Median:168.00 stddev:2.41 (1.4%) stddev-sans-first:2.40 09:43:06 INFO - PROCESS | 1855 | Values: 169.0 166.0 165.0 169.0 164.0 164.0 164.0 167.0 170.0 169.0 09:43:06 INFO - PROCESS | 1855 | 09:43:06 INFO - PROCESS | 1855 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:68.10 Median:68.00 stddev:2.23 (3.3%) stddev-sans-first:0.88 09:43:06 INFO - PROCESS | 1855 | Values: 74.0 68.0 68.0 69.0 68.0 67.0 67.0 67.0 67.0 66.0 09:43:06 INFO - PROCESS | 1855 | -------- Summary: end -------- 09:43:06 INFO - PROCESS | 1855 | 09:43:07 INFO - TEST-INFO | 1855: exit 0 09:43:07 INFO - TEST-OK | kraken | took 65059ms 09:43:07 INFO - SUITE-END | took 1183s 09:43:07 INFO - Completed test suite (00:19:43) 09:43:07 INFO - javascript benchmark 09:43:07 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"extraOptions": ["e10s"], "name": "dromaeo_css", "lowerIsBetter": false, "alertThreshold": 5.0, "value": 6486.617090304002, "subtests": [{"name": "dojo.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [2567.6148577713348, 2609.1650671785023, 2627.88174532146, 2629.579267317231, 2640.6039094135867, 4715.999999999995, 4741.549552792488, 4795.712257264562, 4805.807767689288, 4826.10717017352, 4691.648126390517, 4699.0, 4767.475577686451, 4790.065937142259, 4837.927431088537, 4417.249067658506, 4452.0, 4551.886202844922, 4578.107269082514, 4589.5410458954175, 4167.374893765929, 4556.567126123013, 4576.084783043388, 4576.450825900896, 4580.198465268565, 4375.365571992075, 4381.6494680425485, 4427.358033085185, 4452.554744525554, 4493.505714371417, 4418.094290670405, 4438.955610443886, 4462.330650402433, 4519.615832654228, 4562.703424277444, 4463.062756821071, 4477.037436951038, 4480.5967462928165, 4494.37078808967, 4533.773311334453, 4741.075490279397, 4816.759162041884, 4843.636727245435, 4855.830045948375, 4871.975640121812, 5219.530242278213, 5224.555912747421, 5231.60762942777, 5248.81629142982, 5254.395744489394, 5241.187615919501, 5263.236830659571, 5281.894362112775, 5287.391949925769, 5312.601554883399, 4696.624270058422, 4851.830185943475, 4880.658353915192, 4896.926546101811, 4963.131451995886, 5394.514493695508, 5405.70268635221, 5406.053940560465, 5409.215663728737, 5422.91865622016, 5169.147090730063, 5183.896322073613, 5198.896022079537, 5205.817796377109, 5230.450802665741, 4943.357363542788, 4991.600671946236, 5144.768485418165, 5186.299849520266, 5209.426963034063, 5138.3577052868395, 5179.1195496764885, 5184.533391994739, 5187.403448603383, 5207.895842083137, 5115.641905066684, 5173.586113110942, 5178.585713142939, 5185.455527169668, 5188.662736922088, 4165.312723400605, 4266.189424009428, 4292.441982542312, 4295.291276939332, 4308.138372325548, 3771.7925514096987, 3783.981080094637, 3787.6023017583307, 3814.732968692165, 3826.8469261229798, 4457.9331310030375, 4484.0, 4491.124230774967, 4521.073179998092, 4522.050369422393, 4971.577415919687, 5183.585313174937, 5221.921671174935, 5223.2948551945, 5247.606429517801, 4481.843135490242, 4494.550544945545, 4499.392582001454, 4515.75163366018, 4534.546545345439, 4653.232216684277, 4660.533946605312, 4666.2067448533835, 4667.043256132485, 4734.763261836894, 4789.257665061921, 4803.615710743202, 4812.903741925212, 4814.422269327703, 4946.307516947558, 5073.974630126826, 5099.1841305392445, 5100.872478188075, 5111.284420181103, 5150.0, 4800.4479484859685, 4829.154897892925, 4834.7824347903725, 4857.95142048575, 4876.000419913838, 4919.335889654851, 4959.7272150032095, 4962.801487940442, 5030.547250747304, 5035.521625445577, 5095.108356037605, 5115.15599926023, 5123.692578445305, 5140.023395554833, 5161.122609156378, 5036.823711170092, 5047.545720885138, 5050.368703912011, 5051.04030234269, 5088.771005304696, 5008.198688209869, 5035.244713293036, 5041.0, 5044.596432285482, 5049.671771334852, 4797.976010119927, 4805.13507568641, 4871.464138944784, 4971.925421118758, 4983.975080124576, 5001.174806156943, 5009.098362294676, 5023.723695196653, 5058.2918391425965, 5064.569511591556, 4918.1393256180745, 4935.6051515877925, 4955.776990035385, 5002.224655178453, 5005.949940500548], "value": 4740.367337080275, "unit": "score"}, {"name": "ext.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [562.4150883081595, 562.8902364039013, 571.7084287013622, 579.3308728418676, 591.2550186764676, 35411.645883541154, 39168.608313916855, 39272.60727392725, 39294.60705392945, 39319.41020884689, 40173.59826401735, 40596.39105413421, 40602.59397406025, 40671.0, 40789.184216315654, 7686.846263074721, 7874.055113386402, 7882.290593846553, 7883.408744344169, 7888.368930485547, 7549.207333230014, 7574.091109066892, 7647.235276472364, 7654.387648988096, 7662.501937374081, 7622.428317876153, 7639.541627502367, 7643.541387516739, 7647.61761911905, 7665.118511371208, 7581.772546823604, 7587.544747315151, 7619.4285428593075, 7649.426293028045, 7651.9234807651765, 7611.80970475737, 7614.162442131361, 7675.2324767522805, 7685.538867667958, 7690.0, 37997.24005519902, 38029.0, 38102.0, 38139.23721525554, 38196.80901595474, 3213.951790723141, 3230.660780618048, 3259.4784834426378, 3286.293446908926, 3482.5472688550326, 29581.852090739623, 30067.398652027056, 30107.69892301093, 30246.54630180549, 31082.844585776926, 3348.162959260185, 3359.7816141950693, 3370.4775759757276, 3392.423288041039, 3423.7432192585406, 250461.0, 251327.0, 252305.0, 252307.0, 253962.0, 52941.0, 53335.19997200045, 53376.0, 53398.46601533935, 53452.465475345525, 32165.839170803996, 33819.0, 34181.829090854386, 35722.821385893425, 35925.8203708985, 14667.04664196845, 14691.338889749773, 14800.851991479947, 14811.481598144013, 14827.555173344817, 11234.606788762354, 11268.54925802975, 11282.887171128348, 11287.887121128848, 11323.263987840764, 18566.02943529029, 18574.0, 18636.627267454845, 18666.906665466857, 18678.34625788091, 6557.213184396708, 6986.510944233956, 7029.0, 7074.646267686698, 7129.07514970955, 798.6326289906708, 859.0378775771052, 917.5412293853074, 936.5083331251147, 951.6621599332276, 27364.726352736616, 28446.146615601567, 28665.42669146647, 29191.708082919326, 29194.562081568794, 927.6437847866349, 1005.2912696548915, 1029.1715169288793, 1048.6224959014748, 1068.1454836131063, 13455.32723363828, 13602.93198534001, 13673.24797136167, 13889.652758680912, 14161.0, 402700.0, 403981.0, 406283.0, 406353.0, 407123.0, 49523.0, 49535.25697114546, 49768.25347619789, 49933.50066499361, 50081.74959125181, 1171.1041053594008, 1187.6971372300181, 1206.4751832952518, 1213.1083653514659, 1216.9026477881748, 26482.602760958216, 27159.321016974733, 27975.300617484725, 28345.716542834307, 28431.573526397533, 43222.78388608037, 43347.783261083496, 43348.34977475403, 43492.56507435012, 43559.34660980025, 277960.0, 280240.0, 280382.0, 280992.0, 281036.0, 24386.756132438448, 25491.745082548936, 25675.614865776653, 25941.740582594688, 25946.74053259443, 41969.0, 42202.0, 43425.56574434215, 43515.56484435115, 43900.341494878245, 36364.454533181495, 36785.81607091947, 37137.0, 37864.62135378721, 37897.62102379051, 36348.818255908554, 37068.25863482661, 37280.254394911404, 37427.0, 37901.988132195635, 30757.384852303276, 34780.0, 35884.28231435409, 36405.63594364023, 36522.8173859129, 30873.8456307726, 33832.49251261184, 33836.492452613726, 33880.0, 33954.15114622055, 25269.87365063163, 25756.61365079563, 25863.22410327693, 25873.353166170997, 26198.86900565561], "value": 17339.109251465972, "unit": "score"}, {"name": "jquery.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [357.92662504186643, 372.5213101165003, 373.47340250247146, 378.7462400191871, 395.9030037640778, 16783.41258055968, 16824.831751682494, 17491.212895419703, 17581.648367032667, 17586.912065439687, 16319.673606527893, 16840.83159168411, 16998.0, 17007.82992170078, 17073.48779536616, 5018.673786203894, 5236.083685355066, 5241.711705856176, 5249.685018898859, 5255.842324730264, 3714.2014466889614, 5187.922181167285, 5816.389279125694, 6093.573449858512, 6155.353687862777, 6194.318624951252, 6195.81412557624, 6212.130301757735, 6217.59585626935, 6223.346548612399, 4977.203647416414, 5224.085784987631, 5267.1045922193125, 5325.627206095575, 5335.1730481775, 5138.511841375063, 5173.275741396207, 5192.71440070796, 5207.791688332462, 5214.791408343662, 18573.142685731455, 19295.51761205981, 19314.32399865998, 20337.8983105085, 20921.895390523103, 1747.9825201747947, 1803.2336257090815, 1895.810418958107, 1941.6602094633383, 2533.050106210171, 9210.355275130743, 9355.345125841193, 9454.33819632626, 9778.559964801601, 9826.75433114178, 1661.335465813672, 1685.907275099869, 1691.957701057471, 1702.421176799894, 1766.5142085926345, 62315.065274020926, 68802.0, 69053.65473172652, 69599.0, 72788.0, 9966.551505182284, 10204.846927296096, 10359.171266298677, 10488.213383996232, 10557.0, 14177.92911035459, 14190.219537925306, 14204.85795142056, 14219.36012879423, 14271.215083170526, 7367.926320736831, 7413.88879166813, 7572.924270757222, 7591.202923693043, 7709.0749110107145, 6975.0, 7019.719211231493, 7071.8939215911805, 7241.058662373857, 7247.601381924045, 4333.263345231318, 4360.084382279757, 4433.756143412079, 4448.421705178371, 4520.615747661485, 1547.1877264436262, 1614.1203044340862, 1629.7636842657748, 1841.8710690251821, 1898.9525261868287, 802.5385403393072, 826.8801023851628, 833.5790425834914, 862.1292494580518, 921.589892497832, 16427.753583696252, 16501.33994640201, 16536.0, 17177.65644687099, 17352.826471735374, 848.8090179709516, 858.978525536854, 884.2351366068305, 898.874157617934, 916.1571354354011, 8680.34897382699, 9469.573869175903, 9542.570584323723, 9620.182284505896, 9732.90267097334, 418394.0, 424737.0, 429161.0, 431313.0, 437008.0, 71666.64166679133, 74057.25942740504, 77864.0, 84714.0, 86735.0, 885.57049830832, 912.4114945860016, 933.6405483888751, 939.8919124300656, 943.5093751249312, 15560.221988900736, 15665.138417387154, 15914.840851591336, 16116.194190290204, 16572.917135414245, 34436.311273773885, 34463.82768086143, 34813.82593087018, 38122.237555249296, 38671.41992870165, 47801.521984781095, 49092.0, 50849.74575127101, 51325.23012154896, 51560.484395157066, 7634.351080158027, 7680.193579674054, 7779.922200778146, 7844.80387990282, 7848.64681089341, 11580.189386742848, 11791.941040294743, 11955.342456164646, 12099.274043557414, 12375.876241237473, 10191.7452063699, 10498.580056797642, 10501.0, 10765.784684306112, 10860.891391086305, 10153.136983356497, 10393.58425662965, 10477.37135771856, 10546.0, 10613.204009699459, 10424.166066714493, 10470.476476176313, 10515.211359148247, 10551.841722374324, 11046.171537134907, 7694.269044440769, 7834.216578342121, 7873.409494288066, 7917.129115797143, 8038.437309388287, 7965.920340796518, 10134.138598218939, 10678.62624808128, 10707.732306692395, 10769.62306319275], "value": 8299.759239111558, "unit": "score"}, {"name": "mootools.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [1347.6832944258101, 1395.6929475515385, 1469.478335191007, 1689.7127488326983, 1705.7697210876536, 6943.715412648664, 7579.621018949058, 7676.731314403997, 8231.753047408572, 8257.710980115697, 7781.221877812216, 7958.3633309335255, 7983.281504664579, 7991.840163196733, 8003.479773814698, 2178.1940681947704, 2232.4195709115666, 2245.247841972941, 2246.48330883896, 2246.7528571857083, 2187.2781981946, 2224.788645078723, 2263.920762773303, 2264.2188444986455, 2264.445210923326, 2216.512367279204, 2221.4335344487213, 2229.8550594211406, 2232.8660280383147, 2250.414892128042, 2210.237468073512, 2221.9666704999436, 2223.7998580127864, 2225.8219342452644, 2232.7320721513524, 2174.6629272462637, 2179.8038176564187, 2185.1805572910157, 2185.8579192352445, 2187.147012665062, 8013.67945282188, 8030.0, 8040.035195776544, 8054.0, 8079.111297757242, 4570.154521413516, 4655.88360290992, 4667.276572131325, 4682.204025315705, 4685.344051832746, 2889.653241610999, 2993.670696223414, 3037.2862377341307, 3038.0885734279627, 3047.725704686589, 914.5655813488606, 970.4710932541782, 973.4889183178817, 1715.1938588863213, 1800.9279628814832, 10320.845187322197, 10399.532021058994, 10443.68668939933, 10454.68635940923, 10472.738181545446, 3922.7450215735885, 4077.368007958771, 4141.834326626901, 4169.541350451448, 4174.165166966619, 8319.376046796515, 8327.250547450758, 8356.665733370719, 8381.916180838236, 8402.957985210034, 4579.381783459257, 4623.283391074388, 4629.305604159403, 4638.976805115953, 4647.6281897448125, 3731.776093434403, 4195.769232692171, 4320.265554855682, 4363.5418281080665, 4366.803493842721, 3380.7295416366633, 3458.948115778265, 3546.0, 3566.5363502744476, 3593.065802891267, 1062.1715062251455, 1072.104792498257, 1074.6131392698621, 1079.6868908016588, 1086.147374311162, 679.4089142446104, 793.175097898191, 794.7099308752264, 796.1759578835993, 826.0747962282162, 4946.455889852114, 5034.496550344937, 5053.494650534991, 5107.055194788976, 5274.077036518671, 409.76233784404974, 416.40869964650267, 423.45585922090584, 425.17303844023075, 430.7157276197757, 3452.7583069185416, 3525.8942231732576, 3563.3585954527916, 3568.7145028397667, 3651.160233146338, 9454.243660507143, 9950.950245248872, 9952.701418957442, 9959.55182016811, 9994.350367226107, 9855.852162217572, 9887.604495820087, 9905.504724763732, 9929.453880036523, 9933.65232216869, 7393.408527317802, 7472.0, 7516.24837516244, 7522.322990930843, 7542.0, 5070.062038522885, 5152.6650767699975, 5162.767675454688, 5216.087184742731, 5236.10986132366, 8834.867476987722, 8856.64573417056, 8944.418612790148, 9002.684906028258, 9052.094790520896, 9040.502772347583, 9174.0, 9198.26413886874, 9251.306152038758, 9378.437293762396, 5850.12248162779, 6222.315545290105, 6385.3295403983775, 6439.0, 6452.064450654722, 7566.508176968479, 7592.16486186508, 7660.770176894702, 7661.54030758134, 7681.07827060734, 6745.12313399255, 6783.457323414016, 6809.829754256183, 6811.114555107804, 6859.005444210661, 6566.24488183865, 6678.198616166092, 6708.496862735216, 6846.4522838173825, 6901.516893817385, 6073.757049718139, 6143.324234334309, 6151.231096112986, 6158.876822463615, 6181.443670069715, 4173.561776013475, 4226.2392769300595, 4344.6089851913475, 4398.362237475484, 4476.9328460073775, 4483.574060464251, 4545.977270113761, 4581.289900065495, 4617.145828021827, 4705.176594096088], "value": 4076.396071958756, "unit": "score"}, {"name": "prototype.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [298.26775266720205, 299.1131295708225, 306.23288661901944, 309.2747507095861, 309.54342345041056, 5000.649954503187, 5056.924146137811, 5061.949380506194, 5065.138926382515, 5079.501547043622, 4972.627052971024, 4981.061173907394, 4982.9252561211615, 4983.931668357627, 4986.803167239864, 3696.611855755147, 3844.942325865114, 3910.452536644872, 3951.486306780129, 3965.583613720561, 3935.4490371348033, 3945.7237993340477, 3958.2875082485143, 3964.1278918637854, 3966.9884179534324, 3949.1509325495012, 3953.8220780064967, 3972.7020473464604, 3988.441618173458, 4003.0, 3820.2550502651993, 3934.8229329680235, 3941.1723538056754, 3976.383660532622, 3988.8432354617125, 3467.583889933199, 3468.8785892493893, 3469.60099588548, 3472.73954453417, 3509.1578021274963, 4867.9269810952865, 4870.561649451566, 4879.170541008037, 4905.141600219948, 4918.213085906238, 4396.296592545209, 4525.683202175849, 4532.235336444766, 4539.818407263706, 4554.817807287704, 5205.96967182799, 5206.453322401131, 5222.556082732972, 5223.817166399196, 5282.7622756976025, 3781.2248489059675, 3789.9621003789885, 3790.1851102013197, 3816.8282427290837, 3817.9045523862123, 5401.352587460823, 5522.0, 5530.419305972895, 5561.360443548962, 5574.0, 3822.694184465236, 3872.9031774205305, 3887.425592634931, 3893.9415908761393, 3908.4332771748504, 3904.4924159859606, 3934.4688467057154, 3935.665468435158, 3954.9604503955165, 3967.603239676067, 4467.932981005288, 4480.865574032784, 4482.731036137842, 4498.527654596286, 4503.707259028152, 5111.284420181178, 5236.607254455931, 5257.185136303879, 5262.815801447007, 5275.973620131952, 1354.6410201296665, 1370.4312710225145, 1375.21612680773, 1375.5391943698974, 1379.2689874366602, 856.5631527920681, 884.5754038061766, 897.9371443998857, 909.508865212791, 914.3782228084833, 4416.205083085076, 4496.775161241925, 4608.677392582554, 4631.0, 4634.513376095529, 5425.457454254622, 5473.31583552056, 5492.725363731797, 5494.5054945055135, 5508.3114610673665, 4473.910521789546, 4628.773375055613, 4634.165850146938, 4660.277656963176, 4692.483826779052, 2893.450244453547, 2899.1012786036395, 2912.0244718019276, 2917.810342327742, 2931.8240905545736, 5141.0, 5180.394077835883, 5214.687118772886, 5215.087359712035, 5218.295530103387, 5408.323959505062, 5490.450954904478, 5544.22380866679, 5573.303337082864, 5578.0, 5132.8964272680805, 5141.100307446182, 5154.329937108152, 5157.948420515747, 5164.715940623302, 5426.240326354235, 5451.48210919962, 5464.644798088111, 5475.75359108849, 5498.780048798003, 5050.84847454577, 5287.603429742861, 5291.3121294231505, 5291.841244762663, 5296.390915044665, 5115.616328775282, 5124.38507379102, 5137.537621614073, 5166.199239117943, 5167.689938603696, 3927.9018024549614, 3943.881683549498, 3957.8416863325147, 3960.9009774755864, 3973.2053589282837, 5297.576193904555, 5402.892407056623, 5408.1617349309345, 5430.266913966564, 5504.366997795145, 5222.616006758288, 5239.47605239473, 5243.8164664236565, 5248.606354523502, 5263.842084737464, 5206.869828254324, 5225.477452254744, 5234.712090835041, 5235.869103272448, 5246.895062098813, 4985.326980857682, 5112.284280200701, 5122.79508819658, 5125.513076257749, 5145.511176438233, 4917.434495033117, 5022.924656130088, 5156.097682905552, 5182.663126896739, 5191.195364718475, 5059.443461219189, 5068.569171620454, 5073.619478539198, 5083.542481176712, 5105.2086926526445], "value": 3976.708440532231, "unit": "score"}, {"name": "yui.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [567.7955935863089, 586.1913870395358, 598.8802239552091, 626.9153664255325, 730.5142080516457, 13168.868311316885, 13498.797518037238, 13602.183868967868, 13788.103773254745, 13789.517366892149, 13064.0, 13154.210747355166, 13302.667433314173, 13342.399592018359, 13355.53255636053, 763.3435245688717, 782.3037496628006, 783.5377127494777, 783.6786917363881, 784.8587254294225, 620.2866703291206, 763.3015790551666, 782.0615261685971, 786.7128498098182, 788.5544667262978, 834.5284914023588, 834.5410024486539, 834.8413801377749, 836.0427310729242, 839.6977088248226, 822.839546288474, 824.488816933499, 825.3644693585966, 825.3727167352826, 826.5784449930519, 602.9879402411927, 606.7633622887033, 608.3612207182441, 608.6256951974548, 609.2871340531589, 12582.622521324374, 12593.685157871036, 12597.118201725883, 12604.495820167182, 12649.114561980665, 13421.86578134216, 13667.589972300846, 14121.929390353085, 14300.92849535756, 14559.053661512075, 10402.739931501697, 10550.577976880915, 10608.045275925204, 10645.520951557199, 10801.891981080167, 3389.559357283562, 3394.389009978203, 3397.456406974872, 3402.574678165229, 3425.0581090200394, 62151.378486215464, 63431.0, 63851.0, 63924.36075639277, 64473.0, 9866.605335786488, 10097.646582369582, 10228.48857557134, 10327.535260913277, 10459.267851250339, 20397.592048158953, 20464.59070818605, 20635.380938571867, 20644.0, 20723.896380518, 6420.903686444707, 6475.449586785082, 6534.967325163344, 6715.1941766988275, 6946.79159625212, 3677.742558020913, 3763.6048214937587, 3784.848606055782, 3793.791341476245, 3812.370958791824, 2887.812292201, 2998.130542142754, 3005.5341422079614, 3006.9398612027635, 3007.3985202959498, 510.49206039990446, 512.0859266209872, 522.9869253268698, 528.5005669642152, 560.9074502707008, 422.7315654559377, 545.261171113136, 550.119808306714, 584.2988413903333, 592.5407808948099, 8156.184381561797, 8490.350292822164, 8618.482891026559, 8665.35009874262, 8690.130986901258, 541.6506353402034, 554.3347982421111, 561.1078385367205, 562.6624025584616, 564.0495764636601, 3742.856149793689, 3915.4126880967515, 3924.7252692311836, 4076.30702780528, 4090.877273681735, 103685.0, 103903.0, 106689.4665526683, 107104.0, 108028.0, 55553.72223138859, 56416.0, 89528.5523572378, 90039.0, 96439.0, 62719.0, 62803.0, 63840.0, 82531.93670158293, 85056.0, 8324.29243514284, 8972.416792908702, 9338.533073346169, 9394.67118650844, 9497.477638729937, 43555.564444356416, 44381.556184437744, 44576.331355029055, 45098.77450612726, 47330.76334618305, 63943.36056639374, 68884.0, 69230.0, 69783.0, 72172.27827721655, 11616.535338586362, 11875.109366797353, 11879.928644899219, 11957.342346171044, 12295.016398688262, 13428.597142085753, 13506.459741610619, 13659.521916732867, 13877.306134693426, 13914.234717090658, 12681.112322137362, 12685.365731713562, 12848.164869283466, 13079.476820927437, 13456.5290214842, 12748.0, 12949.093563450844, 13038.674033149247, 13191.208527488381, 13316.514013053611, 12726.381316020395, 12869.549565765154, 13122.73754524885, 13417.329133543479, 13428.328583570978, 10739.570417183226, 10758.963308792585, 10925.890741092488, 11129.220954533104, 11537.82693259585, 10285.177185825265, 10824.296420732628, 10941.343519388862, 11062.391568463812, 11066.39134847591], "value": 6735.31143895774, "unit": "score"}]}, {"extraOptions": ["e10s"], "name": "kraken", "lowerIsBetter": true, "alertThreshold": 2.0, "value": 1572.7, "subtests": [{"name": "ai-astar", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [104.0, 115.0, 108.0, 115.0, 116.0, 114.0, 116.0, 114.0, 114.0, 114.0], "value": 113.0, "unit": "score"}, {"name": "audio-beat-detection", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [161.0, 126.0, 145.0, 180.0, 124.0, 151.0, 151.0, 125.0, 191.0, 133.0], "value": 148.7, "unit": "score"}, {"name": "audio-dft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [165.0, 164.0, 165.0, 168.0, 171.0, 165.0, 164.0, 163.0, 164.0, 163.0], "value": 165.2, "unit": "score"}, {"name": "audio-fft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [76.0, 77.0, 80.0, 151.0, 78.0, 76.0, 76.0, 76.0, 160.0, 77.0], "value": 92.7, "unit": "score"}, {"name": "audio-oscillator", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [86.0, 85.0, 161.0, 86.0, 86.0, 85.0, 138.0, 85.0, 86.0, 144.0], "value": 104.2, "unit": "score"}, {"name": "imaging-gaussian-blur", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [117.0, 117.0, 118.0, 118.0, 118.0, 123.0, 119.0, 119.0, 119.0, 117.0], "value": 118.5, "unit": "score"}, {"name": "imaging-darkroom", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [149.0, 148.0, 148.0, 148.0, 147.0, 148.0, 148.0, 148.0, 147.0, 147.0], "value": 147.8, "unit": "score"}, {"name": "imaging-desaturate", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [96.0, 96.0, 100.0, 97.0, 95.0, 96.0, 97.0, 96.0, 96.0, 95.0], "value": 96.4, "unit": "score"}, {"name": "json-parse-financial", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [64.0, 64.0, 63.0, 64.0, 63.0, 63.0, 65.0, 63.0, 62.0, 64.0], "value": 63.5, "unit": "score"}, {"name": "json-stringify-tinderbox", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [66.0, 67.0, 66.0, 66.0, 67.0, 67.0, 66.0, 67.0, 68.0, 67.0], "value": 66.7, "unit": "score"}, {"name": "stanford-crypto-aes", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [89.0, 81.0, 80.0, 81.0, 80.0, 80.0, 80.0, 80.0, 83.0, 78.0], "value": 81.2, "unit": "score"}, {"name": "stanford-crypto-ccm", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [131.0, 132.0, 138.0, 132.0, 148.0, 131.0, 147.0, 130.0, 169.0, 142.0], "value": 140.0, "unit": "score"}, {"name": "stanford-crypto-pbkdf2", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [169.0, 166.0, 165.0, 169.0, 164.0, 164.0, 164.0, 167.0, 170.0, 169.0], "value": 166.7, "unit": "score"}, {"name": "stanford-crypto-sha256-iterative", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [74.0, 68.0, 68.0, 69.0, 68.0, 67.0, 67.0, 67.0, 67.0, 66.0], "value": 68.1, "unit": "score"}]}]} 09:43:07 INFO - Return code: 0 09:43:07 INFO - Validating PERFHERDER_DATA against /builds/slave/test/scripts/external_tools/performance-artifact-schema.json 09:43:07 ERROR - # TBPL SUCCESS # 09:43:07 INFO - Running post-action listener: _resource_record_post_action 09:43:07 INFO - [mozharness: 2016-07-20 16:43:07.809756Z] Finished run-tests step (success) 09:43:07 INFO - Running post-run listener: _resource_record_post_run 09:43:07 INFO - Total resource usage - Wall time: 1200s; CPU: 13.0%; Read bytes: 4096; Write bytes: 560451584; Read time: 348; Write time: 1369896 09:43:07 INFO - TinderboxPrint: CPU usage
13.4% 09:43:07 INFO - TinderboxPrint: I/O read bytes / time
4,096 / 348 09:43:07 INFO - TinderboxPrint: I/O write bytes / time
560,451,584 / 1,369,896 09:43:07 INFO - TinderboxPrint: CPU idle
8,289.8 (86.6%) 09:43:07 INFO - TinderboxPrint: CPU user
1,219.9 (12.7%) 09:43:07 INFO - TinderboxPrint: Swap in / out
0 / 0 09:43:07 INFO - install - Wall time: 17s; CPU: 19.0%; Read bytes: 0; Write bytes: 264298496; Read time: 0; Write time: 1004780 09:43:07 INFO - run-tests - Wall time: 1184s; CPU: 13.0%; Read bytes: 4096; Write bytes: 296153088; Read time: 348; Write time: 365116 09:43:08 INFO - Running post-run listener: _upload_blobber_files 09:43:08 INFO - Blob upload gear active. 09:43:08 INFO - Preparing to upload files from /builds/slave/test/build/blobber_upload_dir. 09:43:08 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 09:43:08 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'] 09:43:08 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 09:43:08 INFO - (blobuploader) - INFO - Open directory for files ... 09:43:08 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/resource-usage.json ... 09:43:08 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 09:43:08 INFO - (blobuploader) - INFO - Uploading, attempt #1. 09:43:23 INFO - (blobuploader) - INFO - TinderboxPrint: resource-usage.json: uploaded 09:43:23 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 09:43:23 INFO - (blobuploader) - INFO - Done attempting. 09:43:23 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log ... 09:43:23 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 09:43:23 INFO - (blobuploader) - INFO - Uploading, attempt #1. 09:43:24 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_raw.log: uploaded 09:43:24 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 09:43:24 INFO - (blobuploader) - INFO - Done attempting. 09:43:24 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log ... 09:43:24 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 09:43:24 INFO - (blobuploader) - INFO - Uploading, attempt #1. 09:43:25 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_errorsummary.log: uploaded 09:43:25 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 09:43:25 INFO - (blobuploader) - INFO - Done attempting. 09:43:25 INFO - (blobuploader) - INFO - Iteration through files over. 09:43:25 INFO - Return code: 0 09:43:25 INFO - rmtree: /builds/slave/test/build/uploaded_files.json 09:43:25 INFO - retry: Calling remove with args: ('/builds/slave/test/build/uploaded_files.json',), kwargs: {}, attempt #1 09:43:25 INFO - Setting buildbot property blobber_files to {"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/c99c498693cd83f053972c65aef2e80dc88893536722115da3c3ad2c58f26259f47411f0892b9da5d1431346395775eb9a5bace4d7d975157df1b609229fe689", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/6913d4f815677defd0cfe59ea25231fc17676372a51ac46628a31e1caf125e58893af83dd501c6096995881e8f4a44a424733471a02c4390416b514d8085380f", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/8df92188361d45104388191e3a2b56e9e9581a988e2a2686c64f4fc67ece24200d636adff13b9bc3b2a77296498be04c42c5727b85b03b6c17a1194b06e1472f"} 09:43:25 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test/properties/blobber_files 09:43:25 INFO - Writing to file /builds/slave/test/properties/blobber_files 09:43:25 INFO - Contents: 09:43:25 INFO - blobber_files:{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/c99c498693cd83f053972c65aef2e80dc88893536722115da3c3ad2c58f26259f47411f0892b9da5d1431346395775eb9a5bace4d7d975157df1b609229fe689", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/6913d4f815677defd0cfe59ea25231fc17676372a51ac46628a31e1caf125e58893af83dd501c6096995881e8f4a44a424733471a02c4390416b514d8085380f", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/8df92188361d45104388191e3a2b56e9e9581a988e2a2686c64f4fc67ece24200d636adff13b9bc3b2a77296498be04c42c5727b85b03b6c17a1194b06e1472f"} 09:43:25 INFO - Running post-run listener: copy_logs_to_upload_dir 09:43:25 INFO - Copying logs to upload dir... 09:43:25 INFO - mkdir: /builds/slave/test/build/upload/logs 09:43:25 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1249.078486 ========= master_lag: 0.01 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 49 secs) (at 2016-07-20 09:43:25.341070) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-07-20 09:43:25.344603) ========= bash -c 'for file in `ls -1`; do cat $file; done' in dir /builds/slave/test/properties (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', 'for file in `ls -1`; do cat $file; done'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test/properties SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=df17445c3590ff7897617a0e00000225-1469031754.342282-285633841 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False blobber_files:{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/c99c498693cd83f053972c65aef2e80dc88893536722115da3c3ad2c58f26259f47411f0892b9da5d1431346395775eb9a5bace4d7d975157df1b609229fe689", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/6913d4f815677defd0cfe59ea25231fc17676372a51ac46628a31e1caf125e58893af83dd501c6096995881e8f4a44a424733471a02c4390416b514d8085380f", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/8df92188361d45104388191e3a2b56e9e9581a988e2a2686c64f4fc67ece24200d636adff13b9bc3b2a77296498be04c42c5727b85b03b6c17a1194b06e1472f"} build_url:https://queue.taskcluster.net/v1/task/UteF4m_nQPGrd8te-ixgUg/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 program finished with exit code 0 elapsedTime=0.011409 build_url: 'https://queue.taskcluster.net/v1/task/UteF4m_nQPGrd8te-ixgUg/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2' blobber_files: '{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/c99c498693cd83f053972c65aef2e80dc88893536722115da3c3ad2c58f26259f47411f0892b9da5d1431346395775eb9a5bace4d7d975157df1b609229fe689", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/6913d4f815677defd0cfe59ea25231fc17676372a51ac46628a31e1caf125e58893af83dd501c6096995881e8f4a44a424733471a02c4390416b514d8085380f", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/8df92188361d45104388191e3a2b56e9e9581a988e2a2686c64f4fc67ece24200d636adff13b9bc3b2a77296498be04c42c5727b85b03b6c17a1194b06e1472f"}' ========= master_lag: 0.01 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-07-20 09:43:25.369416) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-07-20 09:43:25.369709) ========= rm -f oauth.txt in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['rm', '-f', 'oauth.txt'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=df17445c3590ff7897617a0e00000225-1469031754.342282-285633841 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004436 ========= master_lag: 0.08 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-07-20 09:43:25.454132) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2016-07-20 09:43:25.454462) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2016-07-20 09:43:25.454767) ========= ========= Total master_lag: 0.17 =========