builder: autoland_ubuntu64_hw_test-dromaeojs-e10s slave: talos-linux64-ix-019 starttime: 1468611715.84 results: success (0) buildid: 20160715110552 builduid: 414ae74d459a46868b9b8c3ffeb997f9 revision: ef57886bcaa6ba1423c1ca65f12b38ffb23d6ef8 ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2016-07-15 12:41:55.841069) ========= master: http://buildbot-master104.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2016-07-15 12:41:55.841549) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-07-15 12:41:55.842115) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-07-15 12:41:55.857004) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-07-15 12:41:55.857408) ========= 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=78329bfc0fd5309db0a6e0ac000001b4-1468611714.282342-933020576 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2016-07-15 12:41:55-- 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% 219M=0s 2016-07-15 12:41:56 (219 MB/s) - `archiver_client.py' saved [12141/12141] program finished with exit code 0 elapsedTime=0.137694 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-07-15 12:41:56.009243) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-07-15 12:41:56.009547) ========= 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=78329bfc0fd5309db0a6e0ac000001b4-1468611714.282342-933020576 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.014930 ========= master_lag: 0.03 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-07-15 12:41:56.059177) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-07-15 12:41:56.059580) ========= bash -c 'python archiver_client.py mozharness --repo integration/autoland --rev ef57886bcaa6ba1423c1ca65f12b38ffb23d6ef8 --destination scripts --debug' in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', u'python archiver_client.py mozharness --repo integration/autoland --rev ef57886bcaa6ba1423c1ca65f12b38ffb23d6ef8 --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=78329bfc0fd5309db0a6e0ac000001b4-1468611714.282342-933020576 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2016-07-15 12:41:56,215 truncating revision to first 12 chars 2016-07-15 12:41:56,215 Setting DEBUG logging. 2016-07-15 12:41:56,215 attempt 1/10 2016-07-15 12:41:56,215 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/integration/autoland/ef57886bcaa6?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2016-07-15 12:41:56,540 unpacking tar archive at: autoland-ef57886bcaa6/testing/mozharness/ program finished with exit code 0 elapsedTime=0.704348 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-07-15 12:41:56.777658) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-07-15 12:41:56.777956) ========= script_repo_revision: ef57886bcaa6ba1423c1ca65f12b38ffb23d6ef8 ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-07-15 12:41:56.778347) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-07-15 12:41:56.778612) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-07-15 12:41:56.788618) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 21 mins, 21 secs) (at 2016-07-15 12:41:56.788995) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Autoland-Non-PGO --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Autoland-Non-PGO in dir /builds/slave/test/. (timeout 3600 secs) (maxTime 7200 secs) watching logfiles {} argv: ['/tools/buildbot/bin/python', 'scripts/scripts/talos_script.py', '--suite', 'dromaeojs-e10s', '--add-option', '--webServer,localhost', '--branch-name', 'Autoland-Non-PGO', '--cfg', 'talos/linux_config.py', '--download-symbols', 'ondemand', '--use-talos-json', '--blob-upload-branch', 'Autoland-Non-PGO'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PROPERTIES_FILE=/builds/slave/test/buildprops.json PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=78329bfc0fd5309db0a6e0ac000001b4-1468611714.282342-933020576 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 12:41:57 INFO - MultiFileLogger online at 20160715 12:41:57 in /builds/slave/test 12:41:57 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Autoland-Non-PGO --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Autoland-Non-PGO 12:41:57 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 12:41:57 INFO - {'append_to_log': False, 12:41:57 INFO - 'base_work_dir': '/builds/slave/test', 12:41:57 INFO - 'blob_upload_branch': 'Autoland-Non-PGO', 12:41:57 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 12:41:57 INFO - 'branch': 'Autoland-Non-PGO', 12:41:57 INFO - 'buildbot_json_path': 'buildprops.json', 12:41:57 INFO - 'config_files': ('talos/linux_config.py',), 12:41:57 INFO - 'default_actions': ('clobber', 12:41:57 INFO - 'read-buildbot-config', 12:41:57 INFO - 'download-and-extract', 12:41:57 INFO - 'populate-webroot', 12:41:57 INFO - 'create-virtualenv', 12:41:57 INFO - 'install', 12:41:57 INFO - 'run-tests'), 12:41:57 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 12:41:57 INFO - 'download_minidump_stackwalk': True, 12:41:57 INFO - 'download_symbols': 'ondemand', 12:41:57 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 12:41:57 INFO - 'tooltool.py': '/tools/tooltool.py', 12:41:57 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 12:41:57 INFO - '/tools/misc-python/virtualenv.py')}, 12:41:57 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 12:41:57 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 12:41:57 INFO - 'installer_path': 'installer.exe', 12:41:57 INFO - 'log_level': 'info', 12:41:57 INFO - 'log_name': 'talos', 12:41:57 INFO - 'log_to_console': True, 12:41:57 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 12:41:57 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 12:41:57 INFO - 'opt_config_files': (), 12:41:57 INFO - 'pip_index': False, 12:41:57 INFO - 'sps_profile': False, 12:41:57 INFO - 'sps_profile_interval': 0, 12:41:57 INFO - 'suite': 'dromaeojs-e10s', 12:41:57 INFO - 'system_bits': '32', 12:41:57 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 12:41:57 INFO - 'title': 'talos-linux64-ix-019', 12:41:57 INFO - 'tooltool_cache': '/builds/tooltool_cache', 12:41:57 INFO - 'use_talos_json': True, 12:41:57 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 12:41:57 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 12:41:57 INFO - 'work_dir': 'build'} 12:41:57 INFO - ##### 12:41:57 INFO - ##### Running clobber step. 12:41:57 INFO - ##### 12:41:57 INFO - Running pre-action listener: _resource_record_pre_action 12:41:57 INFO - Running main action method: clobber 12:41:57 INFO - rmtree: /builds/slave/test/build 12:41:57 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 12:41:57 INFO - Running post-action listener: _resource_record_post_action 12:41:57 INFO - ##### 12:41:57 INFO - ##### Finished clobber step (success) 12:41:57 INFO - ##### 12:41:57 INFO - ##### 12:41:57 INFO - ##### Running read-buildbot-config step. 12:41:57 INFO - ##### 12:41:57 INFO - Running pre-action listener: _resource_record_pre_action 12:41:57 INFO - Running main action method: read_buildbot_config 12:41:57 INFO - Using buildbot properties: 12:41:57 INFO - { 12:41:57 INFO - "project": "", 12:41:57 INFO - "product": "firefox", 12:41:57 INFO - "script_repo_revision": "production", 12:41:57 INFO - "builddir": "autoland_ubuntu64_hw_test-dromaeojs-e10s", 12:41:57 INFO - "repository": "", 12:41:57 INFO - "buildername": "Ubuntu HW 12.04 x64 autoland talos dromaeojs-e10s", 12:41:57 INFO - "buildid": "20160715110552", 12:41:57 INFO - "pgo_build": "False", 12:41:57 INFO - "basedir": "/builds/slave/test", 12:41:57 INFO - "buildnumber": 71, 12:41:57 INFO - "slavename": "talos-linux64-ix-019", 12:41:57 INFO - "master": "http://buildbot-master104.bb.releng.scl3.mozilla.com:8201/", 12:41:57 INFO - "platform": "ubuntu64_hw", 12:41:57 INFO - "scheduler": "tests-autoland-linux64-talos", 12:41:57 INFO - "branch": "autoland", 12:41:57 INFO - "repo_path": "integration/autoland", 12:41:57 INFO - "revision": "ef57886bcaa6ba1423c1ca65f12b38ffb23d6ef8", 12:41:57 INFO - "stage_platform": "linux64", 12:41:57 INFO - "builduid": "414ae74d459a46868b9b8c3ffeb997f9", 12:41:57 INFO - "slavebuilddir": "test" 12:41:57 INFO - } 12:41:57 INFO - Found installer url https://queue.taskcluster.net/v1/task/R58PZ5OhTAuOTpOKUDg9Dw/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2. 12:41:57 INFO - Running post-action listener: _resource_record_post_action 12:41:57 INFO - ##### 12:41:57 INFO - ##### Finished read-buildbot-config step (success) 12:41:57 INFO - ##### 12:41:57 INFO - ##### 12:41:57 INFO - ##### Running download-and-extract step. 12:41:57 INFO - ##### 12:41:57 INFO - Running pre-action listener: _resource_record_pre_action 12:41:57 INFO - Running main action method: download_and_extract 12:41:57 INFO - mkdir: /builds/slave/test/build/tests 12:41:57 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 12:41:57 INFO - https://queue.taskcluster.net/v1/task/R58PZ5OhTAuOTpOKUDg9Dw/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.test_packages.json matches https://queue.taskcluster.net 12:41:57 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/R58PZ5OhTAuOTpOKUDg9Dw/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.test_packages.json 12:41:57 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/R58PZ5OhTAuOTpOKUDg9Dw/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.test_packages.json 12:41:57 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/R58PZ5OhTAuOTpOKUDg9Dw/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 12:41:57 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/R58PZ5OhTAuOTpOKUDg9Dw/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 12:41:58 INFO - Downloaded 1361 bytes. 12:41:58 INFO - Reading from file /builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.test_packages.json 12:41:58 INFO - Using the following test package requirements: 12:41:58 INFO - {u'common': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip'], 12:41:58 INFO - u'cppunittest': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 12:41:58 INFO - u'firefox-50.0a1.en-US.linux-x86_64.cppunittest.tests.zip'], 12:41:58 INFO - u'gtest': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 12:41:58 INFO - u'firefox-50.0a1.en-US.linux-x86_64.gtest.tests.zip'], 12:41:58 INFO - u'jittest': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 12:41:58 INFO - u'jsshell-linux-x86_64.zip'], 12:41:58 INFO - u'mochitest': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 12:41:58 INFO - u'firefox-50.0a1.en-US.linux-x86_64.mochitest.tests.zip'], 12:41:58 INFO - u'mozbase': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip'], 12:41:58 INFO - u'reftest': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 12:41:58 INFO - u'firefox-50.0a1.en-US.linux-x86_64.reftest.tests.zip'], 12:41:58 INFO - u'talos': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 12:41:58 INFO - u'firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip'], 12:41:58 INFO - u'web-platform': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 12:41:58 INFO - u'firefox-50.0a1.en-US.linux-x86_64.web-platform.tests.zip'], 12:41:58 INFO - u'xpcshell': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 12:41:58 INFO - u'firefox-50.0a1.en-US.linux-x86_64.xpcshell.tests.zip']} 12:41:58 INFO - Downloading packages: [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip'] for test suite category: common 12:41:58 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 12:41:58 INFO - https://queue.taskcluster.net/v1/task/R58PZ5OhTAuOTpOKUDg9Dw/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 12:41:58 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/R58PZ5OhTAuOTpOKUDg9Dw/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip 12:41:58 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/R58PZ5OhTAuOTpOKUDg9Dw/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip 12:41:58 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/R58PZ5OhTAuOTpOKUDg9Dw/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 12:41:58 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/R58PZ5OhTAuOTpOKUDg9Dw/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 12:41:59 INFO - Downloaded 22757355 bytes. 12:41:59 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'] 12:41:59 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 12:42:00 INFO - Return code: 0 12:42:00 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 12:42:00 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 12:42:00 INFO - https://queue.taskcluster.net/v1/task/R58PZ5OhTAuOTpOKUDg9Dw/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 12:42:00 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/R58PZ5OhTAuOTpOKUDg9Dw/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip 12:42:00 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/R58PZ5OhTAuOTpOKUDg9Dw/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip 12:42:00 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/R58PZ5OhTAuOTpOKUDg9Dw/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 12:42:00 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/R58PZ5OhTAuOTpOKUDg9Dw/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 12:42:01 INFO - Downloaded 22757355 bytes. 12:42:01 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'] 12:42:01 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 12:42:03 INFO - Return code: 0 12:42: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')]} 12:42:03 INFO - https://queue.taskcluster.net/v1/task/R58PZ5OhTAuOTpOKUDg9Dw/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip matches https://queue.taskcluster.net 12:42:03 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/R58PZ5OhTAuOTpOKUDg9Dw/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip 12:42:03 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/R58PZ5OhTAuOTpOKUDg9Dw/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip 12:42:03 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/R58PZ5OhTAuOTpOKUDg9Dw/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 12:42:03 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/R58PZ5OhTAuOTpOKUDg9Dw/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 12:42:04 INFO - Downloaded 14403317 bytes. 12:42:04 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'] 12:42:04 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 12:42:04 INFO - Return code: 0 12:42:04 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 12:42:04 INFO - https://queue.taskcluster.net/v1/task/R58PZ5OhTAuOTpOKUDg9Dw/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 matches https://queue.taskcluster.net 12:42:04 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/R58PZ5OhTAuOTpOKUDg9Dw/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 12:42:04 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/R58PZ5OhTAuOTpOKUDg9Dw/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 12:42:04 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/R58PZ5OhTAuOTpOKUDg9Dw/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 12:42:04 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/R58PZ5OhTAuOTpOKUDg9Dw/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 12:42:05 INFO - Downloaded 57060872 bytes. 12:42:05 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/R58PZ5OhTAuOTpOKUDg9Dw/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 12:42:05 INFO - mkdir: /builds/slave/test/properties 12:42:05 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 12:42:05 INFO - Writing to file /builds/slave/test/properties/build_url 12:42:05 INFO - Contents: 12:42:05 INFO - build_url:https://queue.taskcluster.net/v1/task/R58PZ5OhTAuOTpOKUDg9Dw/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 12:42:06 INFO - Running post-action listener: _resource_record_post_action 12:42:06 INFO - Running post-action listener: set_extra_try_arguments 12:42:06 INFO - ##### 12:42:06 INFO - ##### Finished download-and-extract step (success) 12:42:06 INFO - ##### 12:42:06 INFO - ##### 12:42:06 INFO - ##### Running populate-webroot step. 12:42:06 INFO - ##### 12:42:06 INFO - Running pre-action listener: _resource_record_pre_action 12:42:06 INFO - Running main action method: populate_webroot 12:42:06 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 12:42:06 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 12:42:06 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 12:42:06 INFO - '--tppagecycles', 12:42:06 INFO - '7'], 12:42:06 INFO - 'tests': ['tsvgm']}}, 12:42:06 INFO - 'suites': {'chromez': {'talos_options': ['--disable-e10s'], 12:42:06 INFO - 'tests': ['tresize', 'tcanvasmark']}, 12:42:06 INFO - 'chromez-e10s': {'tests': ['tresize', 'tcanvasmark']}, 12:42:06 INFO - 'dromaeojs': {'talos_options': ['--disable-e10s'], 12:42:06 INFO - 'tests': ['dromaeo_css', 'kraken']}, 12:42:06 INFO - 'dromaeojs-e10s': {'tests': ['dromaeo_css', 'kraken']}, 12:42:06 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 12:42:06 INFO - 'talos_options': ['--disable-e10s'], 12:42:06 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 12:42:06 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 12:42:06 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 12:42:06 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 12:42:06 INFO - 'talos_options': ['--disable-e10s'], 12:42:06 INFO - 'tests': ['damp', 'tps']}, 12:42:06 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 12:42:06 INFO - 'tests': ['damp', 'tps']}, 12:42:06 INFO - 'g3': {'talos_options': ['--disable-e10s'], 12:42:06 INFO - 'tests': ['dromaeo_dom']}, 12:42:06 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 12:42:06 INFO - 'g4': {'talos_options': ['--disable-e10s'], 12:42:06 INFO - 'tests': ['basic_compositor_video']}, 12:42:06 INFO - 'g4-e10s': {'tests': ['basic_compositor_video']}, 12:42:06 INFO - 'other': {'talos_options': ['--disable-e10s'], 12:42:06 INFO - 'tests': ['a11yr', 12:42:06 INFO - 'ts_paint', 12:42:06 INFO - 'tpaint', 12:42:06 INFO - 'sessionrestore', 12:42:06 INFO - 'sessionrestore_no_auto_restore', 12:42:06 INFO - 'tabpaint']}, 12:42:06 INFO - 'other-e10s': {'tests': ['a11yr', 12:42:06 INFO - 'ts_paint', 12:42:06 INFO - 'tpaint', 12:42:06 INFO - 'sessionrestore', 12:42:06 INFO - 'sessionrestore_no_auto_restore', 12:42:06 INFO - 'tabpaint']}, 12:42:06 INFO - 'other-e10s_l64': {'tests': ['a11yr', 12:42:06 INFO - 'ts_paint', 12:42:06 INFO - 'tpaint', 12:42:06 INFO - 'sessionrestore', 12:42:06 INFO - 'sessionrestore_no_auto_restore', 12:42:06 INFO - 'tabpaint']}, 12:42:06 INFO - 'other-e10s_nol64': {'tests': ['a11yr', 12:42:06 INFO - 'ts_paint', 12:42:06 INFO - 'tpaint', 12:42:06 INFO - 'sessionrestore', 12:42:06 INFO - 'sessionrestore_no_auto_restore', 12:42:06 INFO - 'tabpaint']}, 12:42:06 INFO - 'other_l64': {'talos_options': ['--disable-e10s'], 12:42:06 INFO - 'tests': ['a11yr', 12:42:06 INFO - 'ts_paint', 12:42:06 INFO - 'tpaint', 12:42:06 INFO - 'sessionrestore', 12:42:06 INFO - 'sessionrestore_no_auto_restore', 12:42:06 INFO - 'tabpaint']}, 12:42:06 INFO - 'other_nol64': {'talos_options': ['--disable-e10s'], 12:42:06 INFO - 'tests': ['a11yr', 12:42:06 INFO - 'ts_paint', 12:42:06 INFO - 'tpaint', 12:42:06 INFO - 'sessionrestore', 12:42:06 INFO - 'sessionrestore_no_auto_restore', 12:42:06 INFO - 'tabpaint']}, 12:42:06 INFO - 'svgr': {'talos_options': ['--disable-e10s'], 12:42:06 INFO - 'tests': ['tsvgx', 12:42:06 INFO - 'tsvgr_opacity', 12:42:06 INFO - 'tart', 12:42:06 INFO - 'tscrollx', 12:42:06 INFO - 'cart']}, 12:42:06 INFO - 'svgr-e10s': {'tests': ['tsvgx', 12:42:06 INFO - 'tsvgr_opacity', 12:42:06 INFO - 'tart', 12:42:06 INFO - 'tscrollx', 12:42:06 INFO - 'cart']}, 12:42:06 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 12:42:06 INFO - 'talos_options': ['--disable-e10s'], 12:42:06 INFO - 'tests': ['tp5o']}, 12:42:06 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 12:42:06 INFO - 'tests': ['tp5o']}, 12:42:06 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 12:42:06 INFO - 'talos_options': ['--disable-e10s', 12:42:06 INFO - '--xperf_path', 12:42:06 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 12:42:06 INFO - 'tests': ['tp5n']}, 12:42:06 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 12:42:06 INFO - 'talos_options': ['--xperf_path', 12:42:06 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 12:42:06 INFO - 'tests': ['tp5n']}}, 12:42:06 INFO - 'talos.zip': {'path': '', 12:42:06 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 12:42:06 INFO - Running post-action listener: _resource_record_post_action 12:42:06 INFO - ##### 12:42:06 INFO - ##### Finished populate-webroot step (success) 12:42:06 INFO - ##### 12:42:06 INFO - ##### 12:42:06 INFO - ##### Running create-virtualenv step. 12:42:06 INFO - ##### 12:42:06 INFO - Running pre-action listener: _resource_record_pre_action 12:42:06 INFO - Running main action method: create_virtualenv 12:42:06 INFO - Creating virtualenv /builds/slave/test/build/venv 12:42:06 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 12:42:06 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 12:42:06 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 12:42:06 INFO - Using real prefix '/usr' 12:42:06 INFO - New python executable in /builds/slave/test/build/venv/bin/python 12:42:07 INFO - Installing distribute.............................................................................................................................................................................................done. 12:42:09 INFO - Installing pip.................done. 12:42:09 INFO - Return code: 0 12:42:09 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 12:42:09 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 12:42:09 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 12:42:09 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:42:09 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 12:42:09 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 12:42:09 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:42:09 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 0x1df9030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1f5c8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2028400>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x20b7570>, '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 0x20b8470>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x20b8900>, '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': '78329bfc0fd5309db0a6e0ac000001b4-1468611714.282342-933020576', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 12:42:09 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 12:42:09 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 12:42:09 INFO - Using env: {'DISPLAY': ':0', 12:42:09 INFO - 'HOME': '/home/cltbld', 12:42:09 INFO - 'LANG': 'en_US.UTF-8', 12:42:09 INFO - 'LANGUAGE': 'en_US:en', 12:42:09 INFO - 'LOGNAME': 'cltbld', 12:42:09 INFO - 'MAIL': '/var/mail/cltbld', 12:42:09 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 12:42:09 INFO - 'MOZ_NO_REMOTE': '1', 12:42:09 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 12:42:09 INFO - 'NO_EM_RESTART': '1', 12:42:09 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 12:42:09 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 12:42:09 INFO - 'PWD': '/builds/slave/test', 12:42:09 INFO - 'SHELL': '/bin/bash', 12:42:09 INFO - 'SHLVL': '1', 12:42:09 INFO - 'TERM': 'linux', 12:42:09 INFO - 'TMOUT': '86400', 12:42:09 INFO - 'USER': 'cltbld', 12:42:09 INFO - 'XDG_SESSION_COOKIE': '78329bfc0fd5309db0a6e0ac000001b4-1468611714.282342-933020576', 12:42:09 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 12:42:09 INFO - '_': '/tools/buildbot/bin/python'} 12:42:09 INFO - Ignoring indexes: https://pypi.python.org/simple/ 12:42:09 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 12:42:09 INFO - Cleaning up... 12:42:09 INFO - Return code: 0 12:42:09 INFO - Installing psutil>=3.1.1 into virtualenv /builds/slave/test/build/venv 12:42:09 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 12:42:09 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 12:42:09 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:42:09 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 12:42:09 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 12:42:09 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:42:09 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 0x1df9030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1f5c8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2028400>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x20b7570>, '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 0x20b8470>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x20b8900>, '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': '78329bfc0fd5309db0a6e0ac000001b4-1468611714.282342-933020576', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 12:42:09 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 12:42:09 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 12:42:09 INFO - Using env: {'DISPLAY': ':0', 12:42:09 INFO - 'HOME': '/home/cltbld', 12:42:09 INFO - 'LANG': 'en_US.UTF-8', 12:42:09 INFO - 'LANGUAGE': 'en_US:en', 12:42:09 INFO - 'LOGNAME': 'cltbld', 12:42:09 INFO - 'MAIL': '/var/mail/cltbld', 12:42:09 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 12:42:09 INFO - 'MOZ_NO_REMOTE': '1', 12:42:09 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 12:42:09 INFO - 'NO_EM_RESTART': '1', 12:42:09 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 12:42:09 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 12:42:09 INFO - 'PWD': '/builds/slave/test', 12:42:09 INFO - 'SHELL': '/bin/bash', 12:42:09 INFO - 'SHLVL': '1', 12:42:09 INFO - 'TERM': 'linux', 12:42:09 INFO - 'TMOUT': '86400', 12:42:09 INFO - 'USER': 'cltbld', 12:42:09 INFO - 'XDG_SESSION_COOKIE': '78329bfc0fd5309db0a6e0ac000001b4-1468611714.282342-933020576', 12:42:09 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 12:42:09 INFO - '_': '/tools/buildbot/bin/python'} 12:42:09 INFO - Ignoring indexes: https://pypi.python.org/simple/ 12:42:09 INFO - Downloading/unpacking psutil>=3.1.1 12:42:09 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 12:42:09 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 12:42:09 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 12:42:09 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 12:42:09 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 12:42:09 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 12:42:11 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 12:42:11 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 12:42:11 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 12:42:11 INFO - Installing collected packages: psutil 12:42:11 INFO - Running setup.py install for psutil 12:42:12 INFO - building 'psutil._psutil_linux' extension 12:42:12 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 12:42:12 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 12:42:12 INFO - building 'psutil._psutil_posix' extension 12:42:12 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 12:42:12 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 12:42:12 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 12:42:12 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 12:42:12 INFO - Successfully installed psutil 12:42:12 INFO - Cleaning up... 12:42:12 INFO - Return code: 0 12:42:12 INFO - Installing mozsystemmonitor==0.3 into virtualenv /builds/slave/test/build/venv 12:42:12 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 12:42:12 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 12:42:12 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:42:12 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 12:42:12 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 12:42:12 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:42:12 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'mozsystemmonitor==0.3']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1df9030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1f5c8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2028400>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x20b7570>, '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 0x20b8470>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x20b8900>, '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': '78329bfc0fd5309db0a6e0ac000001b4-1468611714.282342-933020576', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 12:42:12 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'mozsystemmonitor==0.3'] in /builds/slave/test/build 12:42:12 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub mozsystemmonitor==0.3 12:42:12 INFO - Using env: {'DISPLAY': ':0', 12:42:12 INFO - 'HOME': '/home/cltbld', 12:42:12 INFO - 'LANG': 'en_US.UTF-8', 12:42:12 INFO - 'LANGUAGE': 'en_US:en', 12:42:12 INFO - 'LOGNAME': 'cltbld', 12:42:12 INFO - 'MAIL': '/var/mail/cltbld', 12:42:12 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 12:42:12 INFO - 'MOZ_NO_REMOTE': '1', 12:42:12 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 12:42:12 INFO - 'NO_EM_RESTART': '1', 12:42:12 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 12:42:12 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 12:42:12 INFO - 'PWD': '/builds/slave/test', 12:42:12 INFO - 'SHELL': '/bin/bash', 12:42:12 INFO - 'SHLVL': '1', 12:42:12 INFO - 'TERM': 'linux', 12:42:12 INFO - 'TMOUT': '86400', 12:42:12 INFO - 'USER': 'cltbld', 12:42:12 INFO - 'XDG_SESSION_COOKIE': '78329bfc0fd5309db0a6e0ac000001b4-1468611714.282342-933020576', 12:42:12 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 12:42:12 INFO - '_': '/tools/buildbot/bin/python'} 12:42:12 INFO - Ignoring indexes: https://pypi.python.org/simple/ 12:42:12 INFO - Downloading/unpacking mozsystemmonitor==0.3 12:42:12 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 12:42:12 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 12:42:12 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 12:42:12 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 12:42:12 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 12:42:12 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 12:42:14 INFO - Downloading mozsystemmonitor-0.3.tar.gz 12:42:14 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 12:42:14 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.3) 12:42:14 INFO - Installing collected packages: mozsystemmonitor 12:42:14 INFO - Running setup.py install for mozsystemmonitor 12:42:14 INFO - Successfully installed mozsystemmonitor 12:42:14 INFO - Cleaning up... 12:42:14 INFO - Return code: 0 12:42:14 INFO - Installing jsonschema==2.5.1 into virtualenv /builds/slave/test/build/venv 12:42:14 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 12:42:14 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 12:42:14 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:42:14 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 12:42:14 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 12:42:14 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:42:14 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 0x1df9030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1f5c8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2028400>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x20b7570>, '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 0x20b8470>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x20b8900>, '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': '78329bfc0fd5309db0a6e0ac000001b4-1468611714.282342-933020576', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 12:42:14 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 12:42:14 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 12:42:14 INFO - Using env: {'DISPLAY': ':0', 12:42:14 INFO - 'HOME': '/home/cltbld', 12:42:14 INFO - 'LANG': 'en_US.UTF-8', 12:42:14 INFO - 'LANGUAGE': 'en_US:en', 12:42:14 INFO - 'LOGNAME': 'cltbld', 12:42:14 INFO - 'MAIL': '/var/mail/cltbld', 12:42:14 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 12:42:14 INFO - 'MOZ_NO_REMOTE': '1', 12:42:14 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 12:42:14 INFO - 'NO_EM_RESTART': '1', 12:42:14 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 12:42:14 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 12:42:14 INFO - 'PWD': '/builds/slave/test', 12:42:14 INFO - 'SHELL': '/bin/bash', 12:42:14 INFO - 'SHLVL': '1', 12:42:14 INFO - 'TERM': 'linux', 12:42:14 INFO - 'TMOUT': '86400', 12:42:14 INFO - 'USER': 'cltbld', 12:42:14 INFO - 'XDG_SESSION_COOKIE': '78329bfc0fd5309db0a6e0ac000001b4-1468611714.282342-933020576', 12:42:14 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 12:42:14 INFO - '_': '/tools/buildbot/bin/python'} 12:42:15 INFO - Ignoring indexes: https://pypi.python.org/simple/ 12:42:15 INFO - Downloading/unpacking jsonschema==2.5.1 12:42:15 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 12:42:15 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 12:42:15 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 12:42:15 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 12:42:15 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 12:42:15 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 12:42:17 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 12:42:17 INFO - Downloading/unpacking functools32 (from jsonschema==2.5.1) 12:42:17 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 12:42:17 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 12:42:17 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 12:42:17 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 12:42:17 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 12:42:17 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 12:42:17 INFO - Downloading functools32-3.2.3-2.tar.gz 12:42:17 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/functools32/setup.py) egg_info for package functools32 12:42:17 INFO - warning: no files found matching '*.txt' 12:42:17 INFO - no previously-included directories found matching 'build' 12:42:17 INFO - no previously-included directories found matching 'dist' 12:42:17 INFO - no previously-included directories found matching '.git*' 12:42:17 INFO - Installing collected packages: jsonschema, functools32 12:42:17 INFO - Running setup.py install for functools32 12:42:17 INFO - warning: no files found matching '*.txt' 12:42:17 INFO - no previously-included directories found matching 'build' 12:42:17 INFO - no previously-included directories found matching 'dist' 12:42:17 INFO - no previously-included directories found matching '.git*' 12:42:17 INFO - Successfully installed jsonschema functools32 12:42:17 INFO - Cleaning up... 12:42:17 INFO - Return code: 0 12:42:17 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 12:42:17 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 12:42:17 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 12:42:17 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:42:17 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 12:42:17 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 12:42:17 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:42:17 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 0x1df9030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1f5c8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2028400>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x20b7570>, '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 0x20b8470>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x20b8900>, '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': '78329bfc0fd5309db0a6e0ac000001b4-1468611714.282342-933020576', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 12:42:17 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'blobuploader==1.2.4'] in /builds/slave/test/build 12:42:17 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub blobuploader==1.2.4 12:42:17 INFO - Using env: {'DISPLAY': ':0', 12:42:17 INFO - 'HOME': '/home/cltbld', 12:42:17 INFO - 'LANG': 'en_US.UTF-8', 12:42:17 INFO - 'LANGUAGE': 'en_US:en', 12:42:17 INFO - 'LOGNAME': 'cltbld', 12:42:17 INFO - 'MAIL': '/var/mail/cltbld', 12:42:17 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 12:42:17 INFO - 'MOZ_NO_REMOTE': '1', 12:42:17 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 12:42:17 INFO - 'NO_EM_RESTART': '1', 12:42:17 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 12:42:17 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 12:42:17 INFO - 'PWD': '/builds/slave/test', 12:42:17 INFO - 'SHELL': '/bin/bash', 12:42:17 INFO - 'SHLVL': '1', 12:42:17 INFO - 'TERM': 'linux', 12:42:17 INFO - 'TMOUT': '86400', 12:42:17 INFO - 'USER': 'cltbld', 12:42:17 INFO - 'XDG_SESSION_COOKIE': '78329bfc0fd5309db0a6e0ac000001b4-1468611714.282342-933020576', 12:42:17 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 12:42:17 INFO - '_': '/tools/buildbot/bin/python'} 12:42:17 INFO - Ignoring indexes: https://pypi.python.org/simple/ 12:42:17 INFO - Downloading/unpacking blobuploader==1.2.4 12:42:17 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 12:42:17 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 12:42:17 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 12:42:17 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 12:42:17 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 12:42:17 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 12:42:19 INFO - Downloading blobuploader-1.2.4.tar.gz 12:42:19 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 12:42:19 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 12:42:19 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 12:42:19 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 12:42:19 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 12:42:19 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 12:42:19 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 12:42:19 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 12:42:19 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 12:42:20 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 12:42:20 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 12:42:20 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 12:42:20 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 12:42:20 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 12:42:20 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 12:42:20 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 12:42:20 INFO - Downloading docopt-0.6.1.tar.gz 12:42:20 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 12:42:20 INFO - Installing collected packages: blobuploader, requests, docopt 12:42:20 INFO - Running setup.py install for blobuploader 12:42:20 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 12:42:20 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 12:42:20 INFO - Running setup.py install for requests 12:42:20 INFO - Running setup.py install for docopt 12:42:20 INFO - Successfully installed blobuploader requests docopt 12:42:20 INFO - Cleaning up... 12:42:21 INFO - Return code: 0 12:42:21 INFO - Installing None into virtualenv /builds/slave/test/build/venv 12:42:21 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 12:42:21 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 12:42:21 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:42:21 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 12:42:21 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 12:42:21 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:42:21 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 0x1df9030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1f5c8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2028400>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x20b7570>, '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 0x20b8470>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x20b8900>, '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': '78329bfc0fd5309db0a6e0ac000001b4-1468611714.282342-933020576', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 12:42:21 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--no-deps', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test/build/tests/config 12:42:21 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --no-deps --timeout 120 -r /builds/slave/test/build/tests/config/mozbase_requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 12:42:21 INFO - Using env: {'DISPLAY': ':0', 12:42:21 INFO - 'HOME': '/home/cltbld', 12:42:21 INFO - 'LANG': 'en_US.UTF-8', 12:42:21 INFO - 'LANGUAGE': 'en_US:en', 12:42:21 INFO - 'LOGNAME': 'cltbld', 12:42:21 INFO - 'MAIL': '/var/mail/cltbld', 12:42:21 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 12:42:21 INFO - 'MOZ_NO_REMOTE': '1', 12:42:21 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 12:42:21 INFO - 'NO_EM_RESTART': '1', 12:42:21 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 12:42:21 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 12:42:21 INFO - 'PWD': '/builds/slave/test', 12:42:21 INFO - 'SHELL': '/bin/bash', 12:42:21 INFO - 'SHLVL': '1', 12:42:21 INFO - 'TERM': 'linux', 12:42:21 INFO - 'TMOUT': '86400', 12:42:21 INFO - 'USER': 'cltbld', 12:42:21 INFO - 'XDG_SESSION_COOKIE': '78329bfc0fd5309db0a6e0ac000001b4-1468611714.282342-933020576', 12:42:21 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 12:42:21 INFO - '_': '/tools/buildbot/bin/python'} 12:42:21 INFO - Ignoring indexes: https://pypi.python.org/simple/ 12:42:21 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 12:42:21 INFO - Running setup.py (path:/tmp/pip-k7HIpX-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 12:42:21 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 12:42:21 INFO - Running setup.py (path:/tmp/pip-urdGL1-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 12:42:21 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 12:42:21 INFO - Running setup.py (path:/tmp/pip-Aty4x3-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 12:42:21 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 12:42:21 INFO - Running setup.py (path:/tmp/pip-B88FB1-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 12:42:21 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 12:42:21 INFO - Running setup.py (path:/tmp/pip-Wg0lau-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 12:42:21 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 12:42:21 INFO - Running setup.py (path:/tmp/pip-p6so_L-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 12:42:21 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 12:42:21 INFO - Running setup.py (path:/tmp/pip-cPeOJd-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 12:42:21 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 12:42:21 INFO - Running setup.py (path:/tmp/pip-1FURCW-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 12:42:21 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 12:42:21 INFO - Running setup.py (path:/tmp/pip-vBqWU4-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 12:42:21 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 12:42:21 INFO - Running setup.py (path:/tmp/pip-araP6d-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 12:42:21 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 12:42:21 INFO - Running setup.py (path:/tmp/pip-wcG1xw-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 12:42:22 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 12:42:22 INFO - Running setup.py (path:/tmp/pip-c7cqtr-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 12:42:22 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 12:42:22 INFO - Running setup.py (path:/tmp/pip-SEP3JF-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 12:42:22 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 12:42:22 INFO - Running setup.py (path:/tmp/pip-bQRETa-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 12:42:22 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 12:42:22 INFO - Running setup.py (path:/tmp/pip-bXgQMJ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 12:42:22 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 12:42:22 INFO - Running setup.py (path:/tmp/pip-n7zMw5-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 12:42:22 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 12:42:22 INFO - Running setup.py (path:/tmp/pip-4GXOrQ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 12:42:22 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 12:42:22 INFO - Running setup.py install for manifestparser 12:42:22 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 12:42:22 INFO - Running setup.py install for mozcrash 12:42:22 INFO - Running setup.py install for mozdebug 12:42:22 INFO - Running setup.py install for mozdevice 12:42:22 INFO - Installing sutini script to /builds/slave/test/build/venv/bin 12:42:22 INFO - Installing dm script to /builds/slave/test/build/venv/bin 12:42:22 INFO - Running setup.py install for mozfile 12:42:23 INFO - Running setup.py install for mozhttpd 12:42:23 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 12:42:23 INFO - Running setup.py install for mozinfo 12:42:23 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 12:42:23 INFO - Running setup.py install for mozInstall 12:42:23 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 12:42:23 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 12:42:23 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 12:42:23 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 12:42:23 INFO - Running setup.py install for mozleak 12:42:23 INFO - Running setup.py install for mozlog 12:42:23 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 12:42:23 INFO - Running setup.py install for moznetwork 12:42:23 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 12:42:23 INFO - Running setup.py install for mozprocess 12:42:23 INFO - Running setup.py install for mozprofile 12:42:23 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 12:42:23 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 12:42:23 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 12:42:23 INFO - Running setup.py install for mozrunner 12:42:23 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 12:42:23 INFO - Running setup.py install for mozscreenshot 12:42:24 INFO - Running setup.py install for moztest 12:42:24 INFO - Running setup.py install for mozversion 12:42:24 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 12:42:24 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 12:42:24 INFO - Cleaning up... 12:42:24 INFO - Return code: 0 12:42:24 INFO - Installing None into virtualenv /builds/slave/test/build/venv 12:42: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')]} 12:42:24 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 12:42:24 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:42: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')]} 12:42:24 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 12:42:24 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:42:24 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 0x1df9030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1f5c8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2028400>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x20b7570>, '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 0x20b8470>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x20b8900>, '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': '78329bfc0fd5309db0a6e0ac000001b4-1468611714.282342-933020576', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 12:42:24 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test/build/tests/config 12:42:24 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 -r /builds/slave/test/build/tests/config/mozbase_requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 12:42:24 INFO - Using env: {'DISPLAY': ':0', 12:42:24 INFO - 'HOME': '/home/cltbld', 12:42:24 INFO - 'LANG': 'en_US.UTF-8', 12:42:24 INFO - 'LANGUAGE': 'en_US:en', 12:42:24 INFO - 'LOGNAME': 'cltbld', 12:42:24 INFO - 'MAIL': '/var/mail/cltbld', 12:42:24 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 12:42:24 INFO - 'MOZ_NO_REMOTE': '1', 12:42:24 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 12:42:24 INFO - 'NO_EM_RESTART': '1', 12:42:24 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 12:42:24 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 12:42:24 INFO - 'PWD': '/builds/slave/test', 12:42:24 INFO - 'SHELL': '/bin/bash', 12:42:24 INFO - 'SHLVL': '1', 12:42:24 INFO - 'TERM': 'linux', 12:42:24 INFO - 'TMOUT': '86400', 12:42:24 INFO - 'USER': 'cltbld', 12:42:24 INFO - 'XDG_SESSION_COOKIE': '78329bfc0fd5309db0a6e0ac000001b4-1468611714.282342-933020576', 12:42:24 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 12:42:24 INFO - '_': '/tools/buildbot/bin/python'} 12:42:24 INFO - Ignoring indexes: https://pypi.python.org/simple/ 12:42:24 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 12:42:24 INFO - Running setup.py (path:/tmp/pip-HJqAkF-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 12:42:24 INFO - Requirement already satisfied (use --upgrade to upgrade): manifestparser==1.1 from file:///builds/slave/test/build/tests/mozbase/manifestparser in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 1)) 12:42:24 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 12:42:24 INFO - Running setup.py (path:/tmp/pip-W7eTur-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 12:42:24 INFO - Requirement already satisfied (use --upgrade to upgrade): mozcrash==0.17 from file:///builds/slave/test/build/tests/mozbase/mozcrash in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 12:42:24 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 12:42:24 INFO - Running setup.py (path:/tmp/pip-j4YRLD-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 12:42:24 INFO - Requirement already satisfied (use --upgrade to upgrade): mozdebug==0.1 from file:///builds/slave/test/build/tests/mozbase/mozdebug in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 3)) 12:42:24 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 12:42:24 INFO - Running setup.py (path:/tmp/pip-_B6Gnt-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 12:42:24 INFO - Requirement already satisfied (use --upgrade to upgrade): mozdevice==0.48 from file:///builds/slave/test/build/tests/mozbase/mozdevice in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 12:42:24 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 12:42:24 INFO - Running setup.py (path:/tmp/pip-WpYNLL-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 12:42:24 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile==1.2 from file:///builds/slave/test/build/tests/mozbase/mozfile in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 5)) 12:42:24 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 12:42:24 INFO - Running setup.py (path:/tmp/pip-IcDE5i-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 12:42:24 INFO - Requirement already satisfied (use --upgrade to upgrade): mozhttpd==0.7 from file:///builds/slave/test/build/tests/mozbase/mozhttpd in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 6)) 12:42:24 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 12:42:24 INFO - Running setup.py (path:/tmp/pip-066zxL-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 12:42:24 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo==0.9 from file:///builds/slave/test/build/tests/mozbase/mozinfo in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 7)) 12:42:24 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 12:42:24 INFO - Running setup.py (path:/tmp/pip-oXLCf4-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 12:42:25 INFO - Requirement already satisfied (use --upgrade to upgrade): mozInstall==1.12 from file:///builds/slave/test/build/tests/mozbase/mozinstall in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 8)) 12:42:25 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 12:42:25 INFO - Running setup.py (path:/tmp/pip-uEqSA7-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 12:42:25 INFO - Requirement already satisfied (use --upgrade to upgrade): mozleak==0.1 from file:///builds/slave/test/build/tests/mozbase/mozleak in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 9)) 12:42:25 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 12:42:25 INFO - Running setup.py (path:/tmp/pip-gEKyg9-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 12:42:25 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog==3.2 from file:///builds/slave/test/build/tests/mozbase/mozlog in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 12:42:25 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 12:42:25 INFO - Running setup.py (path:/tmp/pip-NhYlLl-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 12:42:25 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork==0.27 from file:///builds/slave/test/build/tests/mozbase/moznetwork in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 11)) 12:42:25 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 12:42:25 INFO - Running setup.py (path:/tmp/pip-dJHdmy-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 12:42:25 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)) 12:42:25 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 12:42:25 INFO - Running setup.py (path:/tmp/pip-ujnCKf-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 12:42:25 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprofile==0.28 from file:///builds/slave/test/build/tests/mozbase/mozprofile in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 13)) 12:42:25 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 12:42:25 INFO - Running setup.py (path:/tmp/pip-sQnHaz-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 12:42:25 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)) 12:42:25 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 12:42:25 INFO - Running setup.py (path:/tmp/pip-Tl5O44-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 12:42:25 INFO - Requirement already satisfied (use --upgrade to upgrade): mozscreenshot==0.1 from file:///builds/slave/test/build/tests/mozbase/mozscreenshot in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 15)) 12:42:25 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 12:42:25 INFO - Running setup.py (path:/tmp/pip-Fw5Qjo-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 12:42:25 INFO - Requirement already satisfied (use --upgrade to upgrade): moztest==0.7 from file:///builds/slave/test/build/tests/mozbase/moztest in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 16)) 12:42:25 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 12:42:25 INFO - Running setup.py (path:/tmp/pip-MQkClz-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 12:42:25 INFO - Requirement already satisfied (use --upgrade to upgrade): mozversion==1.4 from file:///builds/slave/test/build/tests/mozbase/mozversion in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 17)) 12:42:25 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile>=1.0 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozcrash==0.17->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 12:42:25 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog>=3.0 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozcrash==0.17->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 12:42:25 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozdebug==0.1->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 3)) 12:42:25 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork>=0.24 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozdevice==0.48->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 12:42:25 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess>=0.19 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozdevice==0.48->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 12:42:25 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.2->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 12:42:25 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 12:42:25 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 12:42:25 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 12:42:25 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 12:42:25 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 12:42:25 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 12:42:27 INFO - Downloading blessings-1.6.tar.gz 12:42:27 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 12:42:27 INFO - Installing collected packages: blessings 12:42:27 INFO - Running setup.py install for blessings 12:42:27 INFO - Successfully installed blessings 12:42:27 INFO - Cleaning up... 12:42:27 INFO - Return code: 0 12:42:27 INFO - Done creating virtualenv /builds/slave/test/build/venv. 12:42:27 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 12:42:27 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 12:42:28 INFO - Reading from file tmpfile_stdout 12:42:28 INFO - Current package versions: 12:42:28 INFO - argparse == 1.2.1 12:42:28 INFO - blessings == 1.6 12:42:28 INFO - blobuploader == 1.2.4 12:42:28 INFO - docopt == 0.6.1 12:42:28 INFO - functools32 == 3.2.3-2 12:42:28 INFO - jsonschema == 2.5.1 12:42:28 INFO - manifestparser == 1.1 12:42:28 INFO - mozInstall == 1.12 12:42:28 INFO - mozcrash == 0.17 12:42:28 INFO - mozdebug == 0.1 12:42:28 INFO - mozdevice == 0.48 12:42:28 INFO - mozfile == 1.2 12:42:28 INFO - mozhttpd == 0.7 12:42:28 INFO - mozinfo == 0.9 12:42:28 INFO - mozleak == 0.1 12:42:28 INFO - mozlog == 3.2 12:42:28 INFO - moznetwork == 0.27 12:42:28 INFO - mozprocess == 0.23 12:42:28 INFO - mozprofile == 0.28 12:42:28 INFO - mozrunner == 6.12 12:42:28 INFO - mozscreenshot == 0.1 12:42:28 INFO - mozsystemmonitor == 0.3 12:42:28 INFO - moztest == 0.7 12:42:28 INFO - mozversion == 1.4 12:42:28 INFO - psutil == 3.1.1 12:42:28 INFO - requests == 1.2.3 12:42:28 INFO - wsgiref == 0.1.2 12:42:28 INFO - Installing None into virtualenv /builds/slave/test/build/venv 12:42:28 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 12:42:28 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 12:42:28 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:42:28 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 12:42:28 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 12:42:28 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:42:28 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 0x1df9030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1f5c8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2028400>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x20b7570>, '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 0x20b8470>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x20b8900>, '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': '78329bfc0fd5309db0a6e0ac000001b4-1468611714.282342-933020576', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 12:42:28 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test/build/tests/talos/requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test/build/tests/talos 12:42:28 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 -r /builds/slave/test/build/tests/talos/requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 12:42:28 INFO - Using env: {'DISPLAY': ':0', 12:42:28 INFO - 'HOME': '/home/cltbld', 12:42:28 INFO - 'LANG': 'en_US.UTF-8', 12:42:28 INFO - 'LANGUAGE': 'en_US:en', 12:42:28 INFO - 'LOGNAME': 'cltbld', 12:42:28 INFO - 'MAIL': '/var/mail/cltbld', 12:42:28 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 12:42:28 INFO - 'MOZ_NO_REMOTE': '1', 12:42:28 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 12:42:28 INFO - 'NO_EM_RESTART': '1', 12:42:28 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 12:42:28 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 12:42:28 INFO - 'PWD': '/builds/slave/test', 12:42:28 INFO - 'SHELL': '/bin/bash', 12:42:28 INFO - 'SHLVL': '1', 12:42:28 INFO - 'TERM': 'linux', 12:42:28 INFO - 'TMOUT': '86400', 12:42:28 INFO - 'USER': 'cltbld', 12:42:28 INFO - 'XDG_SESSION_COOKIE': '78329bfc0fd5309db0a6e0ac000001b4-1468611714.282342-933020576', 12:42:28 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 12:42:28 INFO - '_': '/tools/buildbot/bin/python'} 12:42:28 INFO - Ignoring indexes: https://pypi.python.org/simple/ 12:42:28 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog>=3.1 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 1)) 12:42:28 INFO - Requirement already satisfied (use --upgrade to upgrade): mozcrash>=0.15 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 2)) 12:42:28 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile>=1.2 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 3)) 12:42:28 INFO - Requirement already satisfied (use --upgrade to upgrade): mozhttpd>=0.7 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 4)) 12:42:28 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo>=0.8 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 5)) 12:42:28 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess>=0.22 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 6)) 12:42:28 INFO - Requirement already satisfied (use --upgrade to upgrade): mozversion>=1.3 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 7)) 12:42:28 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprofile>=0.25 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 8)) 12:42:28 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 9)) 12:42:28 INFO - Requirement already satisfied (use --upgrade to upgrade): blessings>=1.3 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozlog>=3.1->-r /builds/slave/test/build/tests/talos/requirements.txt (line 1)) 12:42:28 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork>=0.24 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozhttpd>=0.7->-r /builds/slave/test/build/tests/talos/requirements.txt (line 4)) 12:42:28 INFO - Cleaning up... 12:42:28 INFO - Return code: 0 12:42:28 INFO - Installing jsonschema into virtualenv /builds/slave/test/build/venv 12:42:28 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 12:42:28 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 12:42:28 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:42:28 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 12:42:28 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 12:42:28 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 12:42:28 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 0x1df9030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1f5c8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2028400>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x20b7570>, '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 0x20b8470>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x20b8900>, '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': '78329bfc0fd5309db0a6e0ac000001b4-1468611714.282342-933020576', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 12:42:28 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema'] in /builds/slave/test/build 12:42:28 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub jsonschema 12:42:28 INFO - Using env: {'DISPLAY': ':0', 12:42:28 INFO - 'HOME': '/home/cltbld', 12:42:28 INFO - 'LANG': 'en_US.UTF-8', 12:42:28 INFO - 'LANGUAGE': 'en_US:en', 12:42:28 INFO - 'LOGNAME': 'cltbld', 12:42:28 INFO - 'MAIL': '/var/mail/cltbld', 12:42:28 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 12:42:28 INFO - 'MOZ_NO_REMOTE': '1', 12:42:28 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 12:42:28 INFO - 'NO_EM_RESTART': '1', 12:42:28 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 12:42:28 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 12:42:28 INFO - 'PWD': '/builds/slave/test', 12:42:28 INFO - 'SHELL': '/bin/bash', 12:42:28 INFO - 'SHLVL': '1', 12:42:28 INFO - 'TERM': 'linux', 12:42:28 INFO - 'TMOUT': '86400', 12:42:28 INFO - 'USER': 'cltbld', 12:42:28 INFO - 'XDG_SESSION_COOKIE': '78329bfc0fd5309db0a6e0ac000001b4-1468611714.282342-933020576', 12:42:28 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 12:42:28 INFO - '_': '/tools/buildbot/bin/python'} 12:42:28 INFO - Ignoring indexes: https://pypi.python.org/simple/ 12:42:28 INFO - Requirement already satisfied (use --upgrade to upgrade): jsonschema in ./venv/lib/python2.7/site-packages 12:42:28 INFO - Cleaning up... 12:42:28 INFO - Return code: 0 12:42:28 INFO - Running post-action listener: _resource_record_post_action 12:42:28 INFO - Running post-action listener: _start_resource_monitoring 12:42:28 INFO - Starting resource monitoring. 12:42:28 INFO - ##### 12:42:28 INFO - ##### Finished create-virtualenv step (success) 12:42:28 INFO - ##### 12:42:28 INFO - ##### 12:42:28 INFO - ##### Running install step. 12:42:28 INFO - ##### 12:42:28 INFO - Running pre-action listener: _resource_record_pre_action 12:42:28 INFO - Running main action method: install 12:42:28 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 12:42:28 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 12:42:28 INFO - Reading from file tmpfile_stdout 12:42:28 INFO - Detecting whether we're running mozinstall >=1.0... 12:42:28 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 12:42:28 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 12:42:28 INFO - Reading from file tmpfile_stdout 12:42:28 INFO - Output received: 12:42:28 INFO - Usage: mozinstall [options] installer 12:42:28 INFO - Options: 12:42:28 INFO - -h, --help show this help message and exit 12:42:28 INFO - -d DEST, --destination=DEST 12:42:28 INFO - Directory to install application into. [default: 12:42:28 INFO - "/builds/slave/test"] 12:42:28 INFO - --app=APP Application being installed. [default: firefox] 12:42:28 INFO - mkdir: /builds/slave/test/build/application 12:42:28 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '/builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2', '--destination', '/builds/slave/test/build/application'] 12:42:28 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall /builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 --destination /builds/slave/test/build/application 12:42:45 INFO - Reading from file tmpfile_stdout 12:42:45 INFO - Output received: 12:42:45 INFO - /builds/slave/test/build/application/firefox/firefox 12:42:45 INFO - Running post-action listener: _resource_record_post_action 12:42:45 INFO - ##### 12:42:45 INFO - ##### Finished install step (success) 12:42:45 INFO - ##### 12:42:45 INFO - ##### 12:42:45 INFO - ##### Running run-tests step. 12:42:45 INFO - ##### 12:42:45 INFO - Running pre-action listener: _resource_record_pre_action 12:42:45 INFO - Running main action method: run_tests 12:42:45 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 12:42:45 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 12:42:45 INFO - Python 2.7.3 12:42:45 INFO - Return code: 0 12:42:45 INFO - grabbing minidump binary from tooltool 12:42:45 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 12:42:45 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 0x20b7570>, '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 0x20b8470>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x20b8900>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 12:42:45 INFO - Running command: ['/tools/tooltool.py', '--url', 'https://api.pub.build.mozilla.org/tooltool/', '--authentication-file', '/builds/relengapi.tok', 'fetch', '-m', '/builds/slave/test/build/tests/config/tooltool-manifests/linux64/releng.manifest', '-o', '-c', '/builds/tooltool_cache'] in /builds/slave/test/build 12:42:45 INFO - Copy/paste: /tools/tooltool.py --url https://api.pub.build.mozilla.org/tooltool/ --authentication-file /builds/relengapi.tok fetch -m /builds/slave/test/build/tests/config/tooltool-manifests/linux64/releng.manifest -o -c /builds/tooltool_cache 12:42:45 INFO - Calling ['/tools/tooltool.py', '--url', 'https://api.pub.build.mozilla.org/tooltool/', '--authentication-file', '/builds/relengapi.tok', 'fetch', '-m', '/builds/slave/test/build/tests/config/tooltool-manifests/linux64/releng.manifest', '-o', '-c', '/builds/tooltool_cache'] with output_timeout 600 12:42:45 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 12:42:45 INFO - Return code: 0 12:42:45 INFO - Chmoding /builds/slave/test/build/linux64-minidump_stackwalk to 0755 12:42:45 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 12:42:45 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 12:42:45 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/linux64-minidump_stackwalk 12:42:45 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 12:42:45 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Autoland-Non-PGO', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/R58PZ5OhTAuOTpOKUDg9Dw/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-019', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log'] in /builds/slave/test/build 12:42:45 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/tests/talos/talos/run_tests.py --branchName Autoland-Non-PGO --suite dromaeojs-e10s --executablePath /builds/slave/test/build/application/firefox/firefox --symbolsPath https://queue.taskcluster.net/v1/task/R58PZ5OhTAuOTpOKUDg9Dw/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.crashreporter-symbols.zip --title talos-linux64-ix-019 --webServer localhost --log-tbpl-level=debug --log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log --log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log 12:42:45 INFO - Using env: {'DISPLAY': ':0', 12:42:45 INFO - 'HOME': '/home/cltbld', 12:42:45 INFO - 'LANG': 'en_US.UTF-8', 12:42:45 INFO - 'LANGUAGE': 'en_US:en', 12:42:45 INFO - 'LOGNAME': 'cltbld', 12:42:45 INFO - 'MAIL': '/var/mail/cltbld', 12:42:45 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 12:42:45 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/linux64-minidump_stackwalk', 12:42:45 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 12:42:45 INFO - 'MOZ_NO_REMOTE': '1', 12:42:45 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 12:42:45 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 12:42:45 INFO - 'NO_EM_RESTART': '1', 12:42:45 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 12:42:45 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 12:42:45 INFO - 'PWD': '/builds/slave/test', 12:42:45 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 12:42:45 INFO - 'SHELL': '/bin/bash', 12:42:45 INFO - 'SHLVL': '1', 12:42:45 INFO - 'TERM': 'linux', 12:42:45 INFO - 'TMOUT': '86400', 12:42:45 INFO - 'USER': 'cltbld', 12:42:45 INFO - 'XDG_SESSION_COOKIE': '78329bfc0fd5309db0a6e0ac000001b4-1468611714.282342-933020576', 12:42:45 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 12:42:45 INFO - '_': '/tools/buildbot/bin/python'} 12:42:45 INFO - Calling ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Autoland-Non-PGO', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/R58PZ5OhTAuOTpOKUDg9Dw/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-019', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log'] with output_timeout 3600 12:42:45 INFO - mozversion application_buildid: 20160715110552 12:42:45 INFO - mozversion application_changeset: ef57886bcaa6ba1423c1ca65f12b38ffb23d6ef8 12:42:45 INFO - mozversion application_display_name: Nightly 12:42:45 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 12:42:45 INFO - mozversion application_name: Firefox 12:42:45 INFO - mozversion application_remotingname: firefox 12:42:45 INFO - mozversion application_repository: https://hg.mozilla.org/integration/autoland 12:42:45 INFO - mozversion application_vendor: Mozilla 12:42:45 INFO - mozversion application_version: 50.0a1 12:42:45 INFO - mozversion platform_buildid: 20160715110552 12:42:45 INFO - mozversion platform_changeset: ef57886bcaa6ba1423c1ca65f12b38ffb23d6ef8 12:42:45 INFO - mozversion platform_repository: https://hg.mozilla.org/integration/autoland 12:42:45 INFO - mozversion platform_version: 50.0a1 12:42:45 INFO - using testdate: 1468611765 12:42:45 INFO - actual date: 1468611765 12:42:45 INFO - starting webserver on 'localhost:44284' 12:42:45 INFO - SUITE-START | Running 2 tests 12:42:45 INFO - TEST-START | dromaeo_css 12:42:45 INFO - operating with platform_type : linux_ 12:42:45 INFO - Initialising browser for dromaeo_css test... 12:42:45 INFO - TEST-INFO | started process 4171 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpCXYhza/profile http://localhost:44284/getInfo.html) 12:42:50 INFO - PROCESS | 4171 | __metrics Screen width/height:1600/1200 12:42:50 INFO - PROCESS | 4171 | colorDepth:24 12:42:50 INFO - PROCESS | 4171 | Browser inner width/height: 1024/697 12:42:50 INFO - PROCESS | 4171 | __metrics 12:42:50 ERROR - PROCESS | 4171 | JavaScript error: chrome://browser/content/tabbrowser.xml, line 2964: TypeError: this.tabs is undefined 12:42:51 INFO - TEST-INFO | 4171: exit 0 12:42:51 INFO - Browser initialized. 12:42:51 INFO - Running cycle 1/1 for dromaeo_css test... 12:42:51 INFO - TEST-INFO | started process 4290 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpCXYhza/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 12:43:03 INFO - PROCESS | 4290 | RSS: Main: 168783872 12:43:03 INFO - PROCESS | 4290 | 12:43:53 INFO - PROCESS | 4290 | 1468611833451 addons.productaddons ERROR Request failed certificate checks: [Exception... "SSL is required and URI scheme is not https." nsresult: "0x8000ffff (NS_ERROR_UNEXPECTED)" location: "JS frame :: resource://gre/modules/CertUtils.jsm :: checkCert :: line 145" data: no] 12:46:06 INFO - PROCESS | 4290 | Cycle 1(1): loaded http://localhost:44284/tests/dromaeo/cssquery-dojo.html (next: http://localhost:44284/tests/dromaeo/cssquery-ext.html) 12:46:07 INFO - PROCESS | 4290 | RSS: Main: 173129728 12:46:07 INFO - PROCESS | 4290 | 12:49:09 INFO - PROCESS | 4290 | Cycle 1(1): loaded http://localhost:44284/tests/dromaeo/cssquery-ext.html (next: http://localhost:44284/tests/dromaeo/cssquery-jquery.html) 12:49:10 INFO - PROCESS | 4290 | RSS: Main: 169541632 12:49:10 INFO - PROCESS | 4290 | 12:52:12 INFO - PROCESS | 4290 | Cycle 1(1): loaded http://localhost:44284/tests/dromaeo/cssquery-jquery.html (next: http://localhost:44284/tests/dromaeo/cssquery-mootools.html) 12:52:12 INFO - PROCESS | 4290 | RSS: Main: 172785664 12:52:12 INFO - PROCESS | 4290 | 12:55:14 INFO - PROCESS | 4290 | Cycle 1(1): loaded http://localhost:44284/tests/dromaeo/cssquery-mootools.html (next: http://localhost:44284/tests/dromaeo/cssquery-prototype.html) 12:55:15 INFO - PROCESS | 4290 | RSS: Main: 167649280 12:55:15 INFO - PROCESS | 4290 | 12:58:18 INFO - PROCESS | 4290 | Cycle 1(1): loaded http://localhost:44284/tests/dromaeo/cssquery-prototype.html (next: http://localhost:44284/tests/dromaeo/cssquery-yui.html) 12:58:18 INFO - PROCESS | 4290 | RSS: Main: 169144320 12:58:18 INFO - PROCESS | 4290 | 13:01:21 INFO - PROCESS | 4290 | Cycle 1(1): loaded http://localhost:44284/tests/dromaeo/cssquery-yui.html (next: http://localhost:44284/tests/dromaeo/cssquery-dojo.html) 13:01:21 INFO - PROCESS | 4290 | RSS: Main: 170622976 13:01:21 INFO - PROCESS | 4290 | 13:01:21 INFO - PROCESS | 4290 | __start_tp_report 13:01:21 INFO - PROCESS | 4290 | _x_x_mozilla_page_load 13:01:21 INFO - PROCESS | 4290 | _x_x_mozilla_page_load_details 13:01:21 INFO - PROCESS | 4290 | |i|pagename|runs| 13:01:21 INFO - PROCESS | 4290 | |0;dojo.html;2614.738526147385;2669.0524863673395;2698.3389069677933;2708.6614173228345;2711.4441539484405;4853.927191092136;4855.732934688591;4873.049755297714;4909.7545122743895;4969.751512424383;4674.55591718787;4800.735959522225;4833.589144922677;4842.66101372904;4890.437599676038;4397.34039894016;4422.447194100738;4542.182407166709;4542.909141817162;4547.499775024761;654.1356973468511;4332.84835030774;4336.197803406364;4386.2324093283705;4444.17782710198;4369.169857727037;4393.868183954454;4402.25161722508;4414.602685758297;4457.487388950248;4385.583369579885;4405;4411;4418.204723149832;4435.356873253392;4288.463942007249;4326.6538676905775;4364.170807546588;4367.847125350598;4424.734515929054;4703.929441058387;4749.928751068736;4784.856454306377;4787.712737235777;4855.5872750816225;5144.665596736238;5156;5169.457206993249;5174.741262936838;5232.529072383504;5127.589792816603;5203.19350500673;5221.765020574083;5222.164453687392;5245.134552798783;4804.591609713144;4847.369841920563;4848.975755121237;4875.049365373789;4898.853034408973;5118.564921981673;5265.4997775211295;5353.892922141536;5356.357237131491;5370.91943620846;5060.696358218519;5100.974495127575;5129.8717532061255;5133.717645529532;5167.896642067213;5201;5201.921971170435;5206.609504287194;5214.739263036833;5261.736913154327;5015.523525265094;5056.6713163644245;5091.287219789232;5168.121419358718;5169.974150129226;5079.238114282887;5091.490850914953;5096.184610462383;5102.744862756847;5146.87132821675;4419.513853476115;4422.049259409242;4422.469303683579;4432.29083346663;4449.13241917823;3802.657760801486;3807.923841523154;3843.788591627487;3844.500214972036;3872.341701910682;4327.264365057885;4403.735775853459;4473.552644735565;4485.035717320791;4515.525869783691;5277.973610131925;5286.524212820865;5305.36335639718;5305.389880163753;5361.383440904268;4304.504981927056;4434.290513517886;4467.977660111744;4478.7760611969925;4514.706544074625;4742.359781429532;4746.169420351424;4750;4751.3348131261655;4794.808207671654;4838.927416088762;4924.335214746106;4944.777485013111;4945.505449455098;4965.4289756678445;5097.898042039213;5152.124138896322;5154.7938082477785;5157.045946499909;5181.404138524118;4825.059113472839;4830.082284365959;4844.46710861812;4845.030993801324;4886.193778026728;5045.949540504548;5092.923606145837;5098.974505127599;5102.515261050195;5144.382674079135;5226.189940559219;5229.555487783581;5285.973570132125;5305.31030965972;5331.333583302087;5159.561437277724;5176.922346164886;5184.351956005499;5194.298769666047;5238.240455133908;4971.328870602422;5029.497050294941;5104.285400044071;5147.356580427447;5162.612804039637;4993.700377977333;5007.899842003067;5015.322931404359;5059.089363914531;5076.949230507647;5151.639385242997;5170.146925757208;5173.094708426086;5174.275601415729;5220.608454366014;4841.757912104451;4892.68197567157;4954.826581069645;5029.5221953914315;5029.748512574283 13:01:21 INFO - PROCESS | 4290 | |1;ext.html;548.7942021741846;550.444051507977;557.4509108528099;569.5358282999355;590.7784580782206;35066.47400288995;39848.40227396591;39901.2019759605;39914.40128398076;39962.40056399156;39743.20513589727;40104.19791604166;40309.59690403095;40343.19313613726;40387.39418908719;7775.533467991911;7960.164182760814;8008.879866802003;8018.0779210390965;8031.518108913455;7998.64006119726;8011.519308841459;8077.030756309251;8090.878636820423;8091;8120.6345714443;8128.268455838974;8141.43009989301;8163.836723265531;8180.918190818105;7985.321247693953;8014.799630009296;8054.7180848670305;8068.757937261891;8095.7166499172545;7937;8054.355651547862;8056.073551541531;8057.59712014397;8076.959615201887;38655.42016869749;39050.60949390498;39066.80466597649;39070.60929390698;39103.60896391028;2680.5175068487665;2981.6272965879266;3159.273367125551;3189.5056266278766;3268.2319654881085;25840.612390814153;27070.05254816092;28023.439531209464;28344.291392715142;28622.713772862215;3198.104530731399;3211.6306624737986;3225.3065590897836;3264.2329052672603;3326.06870076379;226220;226509;227926;228771;228810;32624.347513049604;32657.83671081677;32860.50709239364;33644.49533257003;33677.494837577455;33993.49009764855;34152.658473415446;34233.657663423546;34385.140371490415;34395;13976.371063301973;14072.437102515989;14094.295285235903;14097.506587269396;14127;11319.151063670257;11383.943080284545;11387.544498219979;11442.027427668741;11443.9128282813;7834.569098699626;7927.722529711433;8002.679892804339;8041.3164880984605;8044.477108987897;3034.8027378220345;3073.615798025247;3076.215565030903;3083.105899289181;3120.2199450137464;862.7109918177481;886.7650072730731;889.2485849457198;1021.1167340250778;1040.6825918095053;28817;29492.115236542937;29691.406171876442;29797.404051918842;30026.39947201044;937.8030613571226;960.901754019109;965.3146266151111;978.1294647763497;999.1914634511558;14537.418503259963;14804.241435562702;14835.47796874534;14837.406503739945;15289.6177595561;391415;395488;397624;397957;398579;50283.74858125759;50604;51059;51093.74453127711;51304.743476283125;1089.2974031749477;1102.7573933734566;1165.6969188011178;1174.976500470003;1232.87671232876;26744.331391715365;27960.30099247454;28281;28560;28820.855895720386;42692.359614605186;43554.78222608867;43582.56417435785;43593.12813743771;43620.56379436165;270953;273607;275476;275903;276150;25686.229413117635;25873.76577927759;25877.87061064758;26133.869330653226;26214.73785262123;42560.935976600835;43414.782926085165;43539.346909797016;43921.121577568905;44485;37538.624613754604;37583.2483350326;37775;37970.24059518739;38047;37033.81483092675;37076.81461592675;37174;37344;37406.812965934994;31364.37271254608;36014.27971440609;36230.45654315135;36297.81851090727;37532.43701344427;32288.83855580707;32992;33298.33403331968;33604;33724.662753372155;25583;25930.67270722187;26189;26246.60630090512;26270.080547181522 13:01:21 INFO - PROCESS | 4290 | |2;jquery.html;377.7733359984009;381.89497888080774;383.3463943975522;383.8790780904016;393.1645253835599;16923.661526769472;17253.309867605298;17414.82585174148;18229.17968691409;18239.544011399707;10564.947175264113;10646.520906559204;10895.400752958583;10920.344779313247;10943.83584246237;4715.43414790224;4736.739479328636;4753.16819556578;4756.310335001423;4786.71279723216;4668.603168730645;4694.765261736899;4720.433547974248;4728.1252968201;4742.502037286087;4696.788644511005;4708.034852855174;4714.175019371613;5178.7928482860825;5368;5413.648112872651;5476.835694929158;5488.7530061147345;5510.7049843286995;5511.311086114236;5178.249153872705;5273.736313184326;5281.494773989433;5323.600729945269;5353.732313384316;13252.138610990254;13276.203427794364;13436;13957.58127256184;21993.780062199334;1948.6492431362349;1953.5995121000303;1992.8405727541763;2082.8125468707735;2485.3165379520597;9073.63705451781;9815.411075335503;10052.748681282954;10121.443320617363;10133.949330253301;1800.1179422083217;1821.3443160462223;1822.2255541394854;1840.9631807363778;1863.5620629152138;52503.47496525024;67180;68269.65865170643;71805.64097179534;73643;9911.553980070914;9965.40207587547;10174.796504070026;10269.178465722724;10405.27163098591;13754.31228438574;13836.515721949683;13853.307334633228;13898.791518127236;13902.16587004783;7425.591592462359;7455.669196524511;7508;7555.433342499225;7698.923010769932;7172.964135179291;7237.240089790496;7489.400847932152;7645.503042302233;7684.9615751922;4185.895352616209;4330;4340.370646256339;4399.5380485049245;4547.454305483363;1789.7941736700186;1819.3177558415593;1841.3555255660679;1867.318428773488;1872.7939926608062;834.7412302186342;844.3582877013391;858.3862538285031;860.6772460327377;898.6405437824923;17343.21955512005;17880.55298617519;18166.455006349832;18199.45401637953;18264.17811198499;867.8784970104191;873.7116751472126;877.3025444771422;881.9294456443469;882.9867551986725;7542.886856697154;9918.553665085088;9923;9925.1067403934;9997.250206234561;374957;375267;383470;394721;398744;81087.59456202682;83603.5819820897;84547.15452845515;84622;84698.15301846902;884.3544212724747;899.7300809757178;900.7477906186148;913.456493386434;919.544825311475;15734.685306294039;15901.363945442054;16045.438409655606;16088.276027578553;16148;35660.64339356677;37268;38646.22707545777;39747.60252397439;40328.193436130525;51332.74333628308;53217.20174197468;53421;53867.73066134644;54672.17991730207;6555.573887697285;6767.796966091025;7843.234577337752;8116.2695357418115;8173.386995975206;10322.896771032194;10820.89179108199;11178.161637877029;11290.096792256763;11303.491342889425;7817.983662124115;9580.808383832424;10034.598616055568;10094.8485772712;10318.690439286833;4533;6410.519211059096;8611.6985905493;9657.420554766737;9677.080677335642;5137.743112844268;6128.66292353907;8408.654615261528;9650.662226822027;10071.647492337734;6937.306269373023;7052.717891284291;7124.251953544803;7163.6060016699585;7172.318629730167;9840.11438970496;9845.655402060893;9897.604095836086;10015.449150296512;10039.397636141855 13:01:21 INFO - PROCESS | 4290 | |3;mootools.html;1315.1057281048886;1392.637914142323;1393.707321462493;1682.3775203174828;1700.4643537285763;6895.5173137880365;7515.849683006337;7586.658600362983;8098.473599216047;8102;7501.774946751606;7660.4254680898875;7836.804079897991;7868.567228802413;7873.37013038957;2153.3647573965677;2199.3292045925987;2209.6795964585126;2214.0922221889027;2223.6442169252923;2141.7001619773246;2166.80498755112;2208.7901649343285;2211.9889400552975;2213.6679498075255;2084.8644838085474;2094.581083783242;2100.9264675736354;2131.8507704460694;2215.601191785478;2193.013144085152;2194.3416974907464;2199.076387917071;2205.151016858505;2208.59141058903;2052.9794702052936;2142.1110239250693;2147.3235930681785;2150.763416024236;2155.967660485094;7873.291403773688;7902.407319451064;7907.209279072104;7917.168697286817;7919;4759.7620118994255;4857.417109946794;4870.561649451566;4873.049755297683;4882.218844984821;2902.4630443368046;2904.5788360687584;2927.0779704393262;3010.8494575271366;3019.9547006794915;858.0347109501811;866.1728049712509;877.1886005444937;880.8370451466435;911.2937473458123;10846.783064338748;10873.619423320224;10900.563977440894;10901.509432075576;10928.781424371467;4089.9386509202386;4200.222958752641;4308.46144231971;4313.870583882489;4331.263685173528;9211.861822072675;9227.307951903635;9264.11990860867;9278;9303.209227215762;4833.975830120898;4834.927476087862;4839.854804355875;4861.80552777892;4877.170880950247;3763.3414152523746;4275.123599662062;4416.425864637641;4432.512423633398;4438.889027774331;3736.1033351995325;3779.9244015119543;3844.3272427325664;3852.8844134676006;3889.611038896088;1206.740550781586;1234.925904445736;1235.2897084176634;1236.0914727675151;1237.5173682263924;809.6558962440939;823.3331001888489;830.8919840420707;870.5995242188537;871.5119533061505;5253.238280449314;5285.524302812689;5337.306150200527;5381.19282107687;5409.918851217235;399.8800359892021;401.345806335671;409.25107054091535;413.4088253797099;416.09914535031925;3705.073731567108;3744.4944932433773;3834.789086600208;3907.648311651965;4193.245215861174;9900.306978511435;10029;10110.595576177018;10112.342697724624;10122.746931326776;9822.26333025026;9916.107550320507;9948.651797187063;9951.701448956543;9961.352512086836;7433.479656424107;7473.476856619985;7679.6160191990175;7689.76930692069;7717.6527056281475;5649.4633009864;5660.632058916157;5740.138979152994;5843.795467158629;5856.648601083949;9151.725448236564;9289.62841486333;9482.19401350893;9529;9531.52342382892;9244.815103697754;9357.953210233905;9404.905950940676;9405.952970235105;9522.85715714251;6244.65654389013;6756.628385438848;7002.439804815501;7012.894806577803;7201.963990180225;7751.302382785577;7752.108507521707;7781;7801.297883190313;7856.646450909609;6734.898976515454;6837.145356830396;6890.931090689029;6987.895181572178;7013.368796808311;6736.393724564813;6827.692753825991;6918.446524278146;7002.474814388839;7045.260247674126;6327.145835312174;6332.145160403286;6360.236771587439;6364.4908407326375;6403.743850246125;4482;4507.819687212606;4553.3397657340165;4612.630989520897;4637.489876113557;4639.164950308977;4696.225122854691;4753.0256297458245;4768.284757286435;4796.664233503621 13:01:21 INFO - PROCESS | 4290 | |4;prototype.html;307.87992682853684;310.11616891858205;313.78662509493535;315.43222200039924;318.33309217189986;5101.311322971398;5131.12770828959;5135.614828887839;5143.254228136918;5151.536361727443;5022;5025.874353141174;5039.395272567288;5042.394912610483;5044.84865454036;3739.1026153723046;3887;3981;3992.760434373932;3999.4200840878057;3966.4645272888224;3976.582458841823;3982.1438390745984;3982.7411218270718;3992.341263691502;3958.1687845552324;3964.345882929313;3972.880813575597;3973.1060511384994;3977.880663580097;3703.6111208323277;3917.275304068728;3920.2355540669582;3974.741641793274;3985.3822657488136;3422.1273575238406;3429.3141371725756;3429.794212347267;3436.432988556885;3440.2947395784054;4922.483139270361;4927.581155601778;4934.555889969884;4940.135476291634;4945.579625731817;4251.277282861921;4485.394471746337;4493.236149854532;4500.572445617661;4505;5309;5311.814086506954;5318;5327.575952941403;5328.094223981893;3745.7752534847996;3754.342989976743;3755.75587586806;3765.190484045916;3774.67915227206;5332.813351532716;5527.115661494142;5537.418571050022;5554.666719996772;5557.5831812614215;3779.7543159694533;3828.789416582115;3844.2695887781233;3846.3845784674318;3860.4595356650093;3859.2474467478573;3873.65137137659;3888.3778595424596;3897.317969355408;3906.316394630985;4434.733915965053;4449.174774018456;4456.131054444417;4463.397441345442;4470.9105817883465;5166.3025491558155;5252.212168174804;5289.831169220601;5306.416294207634;5325.973370133124;1331.6937104465833;1338.9330533473287;1344.193483909666;1346.6835293705972;1357.151780137414;842.5239739547136;843.9029511606121;865.3077537969599;865.9220670139717;894.7181637784207;4578.88552786183;4595.770211489412;4614.723116613014;4622.214223581999;4625.814967401334;5360.70516121617;5390.21841832932;5400.594955378362;5411.269478620415;5434.83695489136;4448.288273876229;4531.207038768202;4579;4592.494825569184;4604.769761511911;2870.9138725838257;2875;2882.0633294179056;2897.1887871396043;2902.941941161207;5049.798008079636;5055.6713813602;5069.695818250917;5073.239014147907;5078.21287700407;5261.657992230493;5459.66238271626;5518.696471694096;5528.198411230349;5531.119419397424;5013.849584512471;5030.48475762119;5034.169362055293;5043.773030213576;5047.520485553867;5388.488093631099;5399.7300134993875;5402.162664786964;5419.783208671609;5424.891502170013;5045.445001049955;5269.4730526947;5290.338707661543;5291.470852914677;5328.493793089805;5060.9381324298265;5074.213496907985;5074.904308371964;5080.263361812443;5082.288479612931;3806.333891568909;3819.9236015280094;3830.4445855351373;3831.731778775459;3835.175437280998;5209.583233341399;5324.3910483861855;5353.544948679406;5381.27352807366;5386.7575959082715;5226.8954620908125;5255.527002569787;5262.421133675216;5264.789408423773;5271.815486457956;5250.527452529291;5251.6323857331145;5252.632315738015;5265.657732247391;5271.20931860224;4958.256261560795;5166.199239117943;5181.3005244291535;5192;5195.506426889439;5101.566366858859;5174.741262936914;5266.131088370376;5328.920066198933;5358.571314294769;5188.403333616682;5204.791808327776;5209.47905209476;5212.739363031909;5222.817201397933 13:01:21 INFO - PROCESS | 4290 | |5;yui.html;653.4902775834845;655.3937607712865;724.6594100772638;742.2651574940809;758.2417582417582;12756.617301480946;12932.418041188146;13038.217706937567;13405.262710550916;13800.861991380083;12953.805692914613;13001.479940802381;13040.282784446852;13053.151545149582;13056.608301750939;634.0964126120283;779.4154384211841;781.980450488738;797.1709422200904;800.8718605023197;784.9882251766228;794.3287921706178;797.4656979823503;797.4696826610298;799.1968072087544;850.5449584472309;851.5742128935532;852.075498084579;854.0306751836648;854.8845905802731;834.845553572591;838.7609531283555;843.7679638099542;844.3625063077337;844.4511067805914;614.9944840186283;615.9106929495243;616.5345164400893;616.9907451388233;618.2395653346364;13639.386227619781;13814.93092534541;13816.723665526733;13875.098118622258;13945.721085578332;13356.532521361803;13404.86595134046;13611;13721.45114195441;13918.443262269497;8866.55667216643;9141.588628511732;9155.725328240163;9205.401648892801;9211.217046551052;3272.1001724525945;3333.749968752329;3348.380549598308;3348.8325583720716;3414.3000684859544;70158.29841701569;70938.29061709369;71734;72249.27750722478;72307;10422.322549034288;10604.310719803343;11102.777944441066;11145.331280123219;11225.101991840633;19773.60452790965;19833.60332793336;19955.900220499094;19991.20035198605;20020.099095540736;6326.620402775849;6550.181227346582;6559.737610495622;6664.400203981665;6835.453163746888;3571.4107172316276;3627.1657518770303;3650.3976843821;3729.5524537055185;3766.322062028861;2777.0835624244355;2867.655881294258;2888.205743420534;2894.72500112489;2912.796104272723;487.3497503697352;494.6438564233746;497.51989330296436;497.8605990322715;499.59532778449574;542.7747484793766;556.629841155627;557.4258513730864;565.0958466453724;574.6523353371234;7169;7184.49708520409;7354.970304157422;7364.079490063742;7510.248975102555;523.6203752279566;528.4715284715285;537.6800803521899;551.9724013799294;553.335996803837;3506.2111025019167;3523.9119022024142;3525.94711079334;3559.0746405934124;3654.8903532894055;84143.5792821032;93524.53237733767;94534;98488.50755746319;99385.50307248418;82342;82974.58512707398;83209;83318.58340708379;85172;46116.3082553762;56712.716436417555;74597;76121;76672;6883.670758382414;7142.857142857218;7151.82120446993;7179.210286868336;8075.232852878967;37667.73993560395;43615.781921090194;44268.7786561078;44422.55577444184;45941.08117837692;43694.34458483189;46854;64486.67756661187;64726.67636661787;64891.67554162199;11034.393108379116;11177.72055698614;11453.828192576952;11460.598879039528;11760.58837940668;11958.58144964922;12712.618621441372;13033.934830325788;13094.869051309364;13699.931500342833;10861.185411094357;11930.403479826147;12347.259164450163;12790.61628151157;13028.088033837541;12132.272063676208;12328.383580820744;12355.75288494243;12486.750264994831;12879.549215777402;10300.845487317547;11162.776744465227;12148.696282592653;12251.142420030512;12314.384280785745;9315.161635452841;10208.54061567246;10211.948940255252;10330.380177189092;10398.896011039793;10140.847887281845;10426.113780328757;10592.470376481298;10619.734506637396;10657.827638959554 13:01:21 INFO - PROCESS | 4290 | __end_tp_report 13:01:21 INFO - PROCESS | 4290 | __start_cc_report 13:01:21 INFO - PROCESS | 4290 | _x_x_mozilla_cycle_collect,402 13:01:21 INFO - PROCESS | 4290 | __end_cc_report 13:01:21 INFO - PROCESS | 4290 | __startTimestamp1468612881934__endTimestamp 13:01:21 INFO - PROCESS | 4290 | 13:01:21 INFO - PROCESS | 4290 | ------- Summary: start ------- 13:01:21 INFO - PROCESS | 4290 | Number of tests: 6 13:01:21 INFO - PROCESS | 4290 | 13:01:21 INFO - PROCESS | 4290 | [#0] dojo.html Cycles:165 Average:4771.23 Median:4944.78 stddev:610.54 (12.3%) stddev-sans-first:588.51 13:01:21 INFO - PROCESS | 4290 | Values: 2614.7 2669.1 2698.3 2708.7 2711.4 4853.9 4855.7 4873.0 4909.8 4969.8 4674.6 4800.7 4833.6 4842.7 4890.4 4397.3 4422.4 4542.2 4542.9 4547.5 654.1 4332.8 4336.2 4386.2 4444.2 4369.2 4393.9 4402.3 4414.6 4457.5 4385.6 4405.0 4411.0 4418.2 4435.4 4288.5 4326.7 4364.2 4367.8 4424.7 4703.9 4749.9 4784.9 4787.7 4855.6 5144.7 5156.0 5169.5 5174.7 5232.5 5127.6 5203.2 5221.8 5222.2 5245.1 4804.6 4847.4 4849.0 4875.0 4898.9 5118.6 5265.5 5353.9 5356.4 5370.9 5060.7 5101.0 5129.9 5133.7 5167.9 5201.0 5201.9 5206.6 5214.7 5261.7 5015.5 5056.7 5091.3 5168.1 5170.0 5079.2 5091.5 5096.2 5102.7 5146.9 4419.5 4422.0 4422.5 4432.3 4449.1 3802.7 3807.9 3843.8 3844.5 3872.3 4327.3 4403.7 4473.6 4485.0 4515.5 5278.0 5286.5 5305.4 5305.4 5361.4 4304.5 4434.3 4468.0 4478.8 4514.7 4742.4 4746.2 4750.0 4751.3 4794.8 4838.9 4924.3 4944.8 4945.5 4965.4 5097.9 5152.1 5154.8 5157.0 5181.4 4825.1 4830.1 4844.5 4845.0 4886.2 5045.9 5092.9 5099.0 5102.5 5144.4 5226.2 5229.6 5286.0 5305.3 5331.3 5159.6 5176.9 5184.4 5194.3 5238.2 4971.3 5029.5 5104.3 5147.4 5162.6 4993.7 5007.9 5015.3 5059.1 5076.9 5151.6 5170.1 5173.1 5174.3 5220.6 4841.8 4892.7 4954.8 5029.5 5029.7 13:01:21 INFO - PROCESS | 4290 | 13:01:21 INFO - PROCESS | 4290 | [#1] ext.html Cycles:180 Average:44555.33 Median:36264.14 stddev:81170.76 (223.8%) stddev-sans-first:81331.21 13:01:21 INFO - PROCESS | 4290 | Values: 548.8 550.4 557.5 569.5 590.8 35066.5 39848.4 39901.2 39914.4 39962.4 39743.2 40104.2 40309.6 40343.2 40387.4 7775.5 7960.2 8008.9 8018.1 8031.5 7998.6 8011.5 8077.0 8090.9 8091.0 8120.6 8128.3 8141.4 8163.8 8180.9 7985.3 8014.8 8054.7 8068.8 8095.7 7937.0 8054.4 8056.1 8057.6 8077.0 38655.4 39050.6 39066.8 39070.6 39103.6 2680.5 2981.6 3159.3 3189.5 3268.2 25840.6 27070.1 28023.4 28344.3 28622.7 3198.1 3211.6 3225.3 3264.2 3326.1 226220.0 226509.0 227926.0 228771.0 228810.0 32624.3 32657.8 32860.5 33644.5 33677.5 33993.5 34152.7 34233.7 34385.1 34395.0 13976.4 14072.4 14094.3 14097.5 14127.0 11319.2 11383.9 11387.5 11442.0 11443.9 7834.6 7927.7 8002.7 8041.3 8044.5 3034.8 3073.6 3076.2 3083.1 3120.2 862.7 886.8 889.2 1021.1 1040.7 28817.0 29492.1 29691.4 29797.4 30026.4 937.8 960.9 965.3 978.1 999.2 14537.4 14804.2 14835.5 14837.4 15289.6 391415.0 395488.0 397624.0 397957.0 398579.0 50283.7 50604.0 51059.0 51093.7 51304.7 1089.3 1102.8 1165.7 1175.0 1232.9 26744.3 27960.3 28281.0 28560.0 28820.9 42692.4 43554.8 43582.6 43593.1 43620.6 270953.0 273607.0 275476.0 275903.0 276150.0 25686.2 25873.8 25877.9 26133.9 26214.7 42560.9 43414.8 43539.3 43921.1 44485.0 37538.6 37583.2 37775.0 37970.2 38047.0 37033.8 37076.8 37174.0 37344.0 37406.8 31364.4 36014.3 36230.5 36297.8 37532.4 32288.8 32992.0 33298.3 33604.0 33724.7 25583.0 25930.7 26189.0 26246.6 26270.1 13:01:21 INFO - PROCESS | 4290 | 13:01:21 INFO - PROCESS | 4290 | [#2] jquery.html Cycles:180 Average:23952.49 Median:4732.43 stddev:63943.18 (1351.2%) stddev-sans-first:64098.06 13:01:21 INFO - PROCESS | 4290 | Values: 377.8 381.9 383.3 383.9 393.2 16923.7 17253.3 17414.8 18229.2 18239.5 10564.9 10646.5 10895.4 10920.3 10943.8 4715.4 4736.7 4753.2 4756.3 4786.7 4668.6 4694.8 4720.4 4728.1 4742.5 4696.8 4708.0 4714.2 5178.8 5368.0 5413.6 5476.8 5488.8 5510.7 5511.3 5178.2 5273.7 5281.5 5323.6 5353.7 13252.1 13276.2 13436.0 13957.6 21993.8 1948.6 1953.6 1992.8 2082.8 2485.3 9073.6 9815.4 10052.7 10121.4 10133.9 1800.1 1821.3 1822.2 1841.0 1863.6 52503.5 67180.0 68269.7 71805.6 73643.0 9911.6 9965.4 10174.8 10269.2 10405.3 13754.3 13836.5 13853.3 13898.8 13902.2 7425.6 7455.7 7508.0 7555.4 7698.9 7173.0 7237.2 7489.4 7645.5 7685.0 4185.9 4330.0 4340.4 4399.5 4547.5 1789.8 1819.3 1841.4 1867.3 1872.8 834.7 844.4 858.4 860.7 898.6 17343.2 17880.6 18166.5 18199.5 18264.2 867.9 873.7 877.3 881.9 883.0 7542.9 9918.6 9923.0 9925.1 9997.3 374957.0 375267.0 383470.0 394721.0 398744.0 81087.6 83603.6 84547.2 84622.0 84698.2 884.4 899.7 900.7 913.5 919.5 15734.7 15901.4 16045.4 16088.3 16148.0 35660.6 37268.0 38646.2 39747.6 40328.2 51332.7 53217.2 53421.0 53867.7 54672.2 6555.6 6767.8 7843.2 8116.3 8173.4 10322.9 10820.9 11178.2 11290.1 11303.5 7818.0 9580.8 10034.6 10094.8 10318.7 4533.0 6410.5 8611.7 9657.4 9677.1 5137.7 6128.7 8408.7 9650.7 10071.6 6937.3 7052.7 7124.3 7163.6 7172.3 9840.1 9845.7 9897.6 10015.4 10039.4 13:01:21 INFO - PROCESS | 4290 | 13:01:21 INFO - PROCESS | 4290 | [#3] mootools.html Cycles:180 Average:5264.44 Median:4871.81 stddev:2989.85 (61.4%) stddev-sans-first:2983.51 13:01:21 INFO - PROCESS | 4290 | Values: 1315.1 1392.6 1393.7 1682.4 1700.5 6895.5 7515.8 7586.7 8098.5 8102.0 7501.8 7660.4 7836.8 7868.6 7873.4 2153.4 2199.3 2209.7 2214.1 2223.6 2141.7 2166.8 2208.8 2212.0 2213.7 2084.9 2094.6 2100.9 2131.9 2215.6 2193.0 2194.3 2199.1 2205.2 2208.6 2053.0 2142.1 2147.3 2150.8 2156.0 7873.3 7902.4 7907.2 7917.2 7919.0 4759.8 4857.4 4870.6 4873.0 4882.2 2902.5 2904.6 2927.1 3010.8 3020.0 858.0 866.2 877.2 880.8 911.3 10846.8 10873.6 10900.6 10901.5 10928.8 4089.9 4200.2 4308.5 4313.9 4331.3 9211.9 9227.3 9264.1 9278.0 9303.2 4834.0 4834.9 4839.9 4861.8 4877.2 3763.3 4275.1 4416.4 4432.5 4438.9 3736.1 3779.9 3844.3 3852.9 3889.6 1206.7 1234.9 1235.3 1236.1 1237.5 809.7 823.3 830.9 870.6 871.5 5253.2 5285.5 5337.3 5381.2 5409.9 399.9 401.3 409.3 413.4 416.1 3705.1 3744.5 3834.8 3907.6 4193.2 9900.3 10029.0 10110.6 10112.3 10122.7 9822.3 9916.1 9948.7 9951.7 9961.4 7433.5 7473.5 7679.6 7689.8 7717.7 5649.5 5660.6 5740.1 5843.8 5856.6 9151.7 9289.6 9482.2 9529.0 9531.5 9244.8 9358.0 9404.9 9406.0 9522.9 6244.7 6756.6 7002.4 7012.9 7202.0 7751.3 7752.1 7781.0 7801.3 7856.6 6734.9 6837.1 6890.9 6987.9 7013.4 6736.4 6827.7 6918.4 7002.5 7045.3 6327.1 6332.1 6360.2 6364.5 6403.7 4482.0 4507.8 4553.3 4612.6 4637.5 4639.2 4696.2 4753.0 4768.3 4796.7 13:01:21 INFO - PROCESS | 4290 | 13:01:21 INFO - PROCESS | 4290 | [#4] prototype.html Cycles:180 Average:4368.92 Median:5036.78 stddev:1267.62 (25.2%) stddev-sans-first:1233.98 13:01:21 INFO - PROCESS | 4290 | Values: 307.9 310.1 313.8 315.4 318.3 5101.3 5131.1 5135.6 5143.3 5151.5 5022.0 5025.9 5039.4 5042.4 5044.8 3739.1 3887.0 3981.0 3992.8 3999.4 3966.5 3976.6 3982.1 3982.7 3992.3 3958.2 3964.3 3972.9 3973.1 3977.9 3703.6 3917.3 3920.2 3974.7 3985.4 3422.1 3429.3 3429.8 3436.4 3440.3 4922.5 4927.6 4934.6 4940.1 4945.6 4251.3 4485.4 4493.2 4500.6 4505.0 5309.0 5311.8 5318.0 5327.6 5328.1 3745.8 3754.3 3755.8 3765.2 3774.7 5332.8 5527.1 5537.4 5554.7 5557.6 3779.8 3828.8 3844.3 3846.4 3860.5 3859.2 3873.7 3888.4 3897.3 3906.3 4434.7 4449.2 4456.1 4463.4 4470.9 5166.3 5252.2 5289.8 5306.4 5326.0 1331.7 1338.9 1344.2 1346.7 1357.2 842.5 843.9 865.3 865.9 894.7 4578.9 4595.8 4614.7 4622.2 4625.8 5360.7 5390.2 5400.6 5411.3 5434.8 4448.3 4531.2 4579.0 4592.5 4604.8 2870.9 2875.0 2882.1 2897.2 2902.9 5049.8 5055.7 5069.7 5073.2 5078.2 5261.7 5459.7 5518.7 5528.2 5531.1 5013.8 5030.5 5034.2 5043.8 5047.5 5388.5 5399.7 5402.2 5419.8 5424.9 5045.4 5269.5 5290.3 5291.5 5328.5 5060.9 5074.2 5074.9 5080.3 5082.3 3806.3 3819.9 3830.4 3831.7 3835.2 5209.6 5324.4 5353.5 5381.3 5386.8 5226.9 5255.5 5262.4 5264.8 5271.8 5250.5 5251.6 5252.6 5265.7 5271.2 4958.3 5166.2 5181.3 5192.0 5195.5 5101.6 5174.7 5266.1 5328.9 5358.6 5188.4 5204.8 5209.5 5212.7 5222.8 13:01:21 INFO - PROCESS | 4290 | 13:01:21 INFO - PROCESS | 4290 | [#5] yui.html Cycles:180 Average:17514.55 Median:46485.15 stddev:24834.65 (53.4%) stddev-sans-first:24872.05 13:01:21 INFO - PROCESS | 4290 | Values: 653.5 655.4 724.7 742.3 758.2 12756.6 12932.4 13038.2 13405.3 13800.9 12953.8 13001.5 13040.3 13053.2 13056.6 634.1 779.4 782.0 797.2 800.9 785.0 794.3 797.5 797.5 799.2 850.5 851.6 852.1 854.0 854.9 834.8 838.8 843.8 844.4 844.5 615.0 615.9 616.5 617.0 618.2 13639.4 13814.9 13816.7 13875.1 13945.7 13356.5 13404.9 13611.0 13721.5 13918.4 8866.6 9141.6 9155.7 9205.4 9211.2 3272.1 3333.7 3348.4 3348.8 3414.3 70158.3 70938.3 71734.0 72249.3 72307.0 10422.3 10604.3 11102.8 11145.3 11225.1 19773.6 19833.6 19955.9 19991.2 20020.1 6326.6 6550.2 6559.7 6664.4 6835.5 3571.4 3627.2 3650.4 3729.6 3766.3 2777.1 2867.7 2888.2 2894.7 2912.8 487.3 494.6 497.5 497.9 499.6 542.8 556.6 557.4 565.1 574.7 7169.0 7184.5 7355.0 7364.1 7510.2 523.6 528.5 537.7 552.0 553.3 3506.2 3523.9 3525.9 3559.1 3654.9 84143.6 93524.5 94534.0 98488.5 99385.5 82342.0 82974.6 83209.0 83318.6 85172.0 46116.3 56712.7 74597.0 76121.0 76672.0 6883.7 7142.9 7151.8 7179.2 8075.2 37667.7 43615.8 44268.8 44422.6 45941.1 43694.3 46854.0 64486.7 64726.7 64891.7 11034.4 11177.7 11453.8 11460.6 11760.6 11958.6 12712.6 13033.9 13094.9 13699.9 10861.2 11930.4 12347.3 12790.6 13028.1 12132.3 12328.4 12355.8 12486.8 12879.5 10300.8 11162.8 12148.7 12251.1 12314.4 9315.2 10208.5 10211.9 10330.4 10398.9 10140.8 10426.1 10592.5 10619.7 10657.8 13:01:21 INFO - PROCESS | 4290 | -------- Summary: end -------- 13:01:21 INFO - PROCESS | 4290 | 13:01:22 INFO - TEST-INFO | 4290: exit 0 13:01:22 INFO - TEST-OK | dromaeo_css | took 1117199ms 13:01:22 INFO - TEST-START | kraken 13:01:22 INFO - operating with platform_type : linux_ 13:01:22 INFO - Initialising browser for kraken test... 13:01:22 INFO - TEST-INFO | started process 4530 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpmWWtgA/profile http://localhost:44284/getInfo.html) 13:01:27 INFO - PROCESS | 4530 | __metrics Screen width/height:1600/1200 13:01:27 INFO - PROCESS | 4530 | colorDepth:24 13:01:27 INFO - PROCESS | 4530 | Browser inner width/height: 1024/697 13:01:27 INFO - PROCESS | 4530 | __metrics 13:01:28 ERROR - PROCESS | 4530 | JavaScript error: chrome://browser/content/tabbrowser.xml, line 2964: TypeError: this.tabs is undefined 13:01:29 INFO - TEST-INFO | 4530: exit 0 13:01:29 INFO - Browser initialized. 13:01:29 INFO - Running cycle 1/1 for kraken test... 13:01:29 INFO - TEST-INFO | started process 4649 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpmWWtgA/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 13:01:41 INFO - PROCESS | 4649 | RSS: Main: 169021440 13:01:41 INFO - PROCESS | 4649 | 13:01:43 INFO - PROCESS | 4649 | Cycle 1(1): loaded http://localhost:44284/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:44284/tests/kraken/driver.html?testName=audio-beat-detection) 13:01:44 INFO - PROCESS | 4649 | RSS: Main: 174223360 13:01:44 INFO - PROCESS | 4649 | 13:01:47 INFO - PROCESS | 4649 | Cycle 1(1): loaded http://localhost:44284/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:44284/tests/kraken/driver.html?testName=audio-dft) 13:01:48 INFO - PROCESS | 4649 | RSS: Main: 174374912 13:01:48 INFO - PROCESS | 4649 | 13:01:51 INFO - PROCESS | 4649 | Cycle 1(1): loaded http://localhost:44284/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:44284/tests/kraken/driver.html?testName=audio-fft) 13:01:51 INFO - PROCESS | 4649 | RSS: Main: 168980480 13:01:51 INFO - PROCESS | 4649 | 13:01:53 INFO - PROCESS | 4649 | Cycle 1(1): loaded http://localhost:44284/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:44284/tests/kraken/driver.html?testName=audio-oscillator) 13:01:54 INFO - PROCESS | 4649 | RSS: Main: 169132032 13:01:54 INFO - PROCESS | 4649 | 13:01:56 INFO - PROCESS | 4649 | Cycle 1(1): loaded http://localhost:44284/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:44284/tests/kraken/driver.html?testName=imaging-gaussian-blur) 13:01:57 INFO - PROCESS | 4649 | RSS: Main: 169975808 13:01:57 INFO - PROCESS | 4649 | 13:02:00 INFO - PROCESS | 4649 | Cycle 1(1): loaded http://localhost:44284/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:44284/tests/kraken/driver.html?testName=imaging-darkroom) 13:02:01 INFO - PROCESS | 4649 | RSS: Main: 170221568 13:02:01 INFO - PROCESS | 4649 | 13:02:04 INFO - PROCESS | 4649 | Cycle 1(1): loaded http://localhost:44284/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:44284/tests/kraken/driver.html?testName=imaging-desaturate) 13:02:05 INFO - PROCESS | 4649 | RSS: Main: 167313408 13:02:05 INFO - PROCESS | 4649 | 13:02:08 INFO - PROCESS | 4649 | Cycle 1(1): loaded http://localhost:44284/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:44284/tests/kraken/driver.html?testName=json-parse-financial) 13:02:08 INFO - PROCESS | 4649 | RSS: Main: 168796160 13:02:08 INFO - PROCESS | 4649 | 13:02:10 INFO - PROCESS | 4649 | Cycle 1(1): loaded http://localhost:44284/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:44284/tests/kraken/driver.html?testName=json-stringify-tinderbox) 13:02:11 INFO - PROCESS | 4649 | RSS: Main: 168550400 13:02:11 INFO - PROCESS | 4649 | 13:02:13 INFO - PROCESS | 4649 | Cycle 1(1): loaded http://localhost:44284/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:44284/tests/kraken/driver.html?testName=stanford-crypto-aes) 13:02:13 INFO - PROCESS | 4649 | RSS: Main: 168980480 13:02:13 INFO - PROCESS | 4649 | 13:02:16 INFO - PROCESS | 4649 | Cycle 1(1): loaded http://localhost:44284/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:44284/tests/kraken/driver.html?testName=stanford-crypto-ccm) 13:02:16 INFO - PROCESS | 4649 | RSS: Main: 169971712 13:02:16 INFO - PROCESS | 4649 | 13:02:19 INFO - PROCESS | 4649 | Cycle 1(1): loaded http://localhost:44284/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:44284/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 13:02:20 INFO - PROCESS | 4649 | RSS: Main: 169742336 13:02:20 INFO - PROCESS | 4649 | 13:02:23 INFO - PROCESS | 4649 | Cycle 1(1): loaded http://localhost:44284/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:44284/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 13:02:23 INFO - PROCESS | 4649 | RSS: Main: 169504768 13:02:23 INFO - PROCESS | 4649 | 13:02:25 INFO - PROCESS | 4649 | Cycle 1(1): loaded http://localhost:44284/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:44284/tests/kraken/driver.html?testName=ai-astar) 13:02:25 INFO - PROCESS | 4649 | RSS: Main: 170647552 13:02:25 INFO - PROCESS | 4649 | 13:02:25 INFO - PROCESS | 4649 | __start_tp_report 13:02:25 INFO - PROCESS | 4649 | _x_x_mozilla_page_load 13:02:25 INFO - PROCESS | 4649 | _x_x_mozilla_page_load_details 13:02:25 INFO - PROCESS | 4649 | |i|pagename|runs| 13:02:25 INFO - PROCESS | 4649 | |0;ai-astar;106;115;110;117;114;115;116;114;115;115 13:02:25 INFO - PROCESS | 4649 | |1;audio-beat-detection;154;124;147;169;132;159;156;127;192;124 13:02:25 INFO - PROCESS | 4649 | |2;audio-dft;164;162;165;169;170;162;162;162;161;160 13:02:25 INFO - PROCESS | 4649 | |3;audio-fft;76;75;75;148;76;77;76;76;152;77 13:02:25 INFO - PROCESS | 4649 | |4;audio-oscillator;86;86;162;86;85;87;143;86;85;132 13:02:25 INFO - PROCESS | 4649 | |5;imaging-gaussian-blur;119;118;118;118;118;118;118;118;119;118 13:02:25 INFO - PROCESS | 4649 | |6;imaging-darkroom;149;150;147;148;148;149;149;148;150;149 13:02:25 INFO - PROCESS | 4649 | |7;imaging-desaturate;96;96;95;96;95;96;97;95;96;95 13:02:25 INFO - PROCESS | 4649 | |8;json-parse-financial;71;69;68;67;66;66;67;70;65;72 13:02:25 INFO - PROCESS | 4649 | |9;json-stringify-tinderbox;66;66;66;66;67;66;66;67;66;66 13:02:25 INFO - PROCESS | 4649 | |10;stanford-crypto-aes;84;80;79;77;79;82;85;83;83;86 13:02:25 INFO - PROCESS | 4649 | |11;stanford-crypto-ccm;129;132;143;131;141;136;152;136;176;147 13:02:25 INFO - PROCESS | 4649 | |12;stanford-crypto-pbkdf2;164;173;165;164;165;167;169;172;168;170 13:02:25 INFO - PROCESS | 4649 | |13;stanford-crypto-sha256-iterative;72;68;71;68;68;67;70;70;67;68 13:02:25 INFO - PROCESS | 4649 | __end_tp_report 13:02:25 INFO - PROCESS | 4649 | __start_cc_report 13:02:25 INFO - PROCESS | 4649 | _x_x_mozilla_cycle_collect,988 13:02:25 INFO - PROCESS | 4649 | __end_cc_report 13:02:25 INFO - PROCESS | 4649 | __startTimestamp1468612945764__endTimestamp 13:02:25 INFO - PROCESS | 4649 | 13:02:25 INFO - PROCESS | 4649 | ------- Summary: start ------- 13:02:25 INFO - PROCESS | 4649 | Number of tests: 14 13:02:25 INFO - PROCESS | 4649 | 13:02:25 INFO - PROCESS | 4649 | [#0] ai-astar Cycles:10 Average:113.70 Median:115.00 stddev:3.27 (2.8%) stddev-sans-first:1.94 13:02:25 INFO - PROCESS | 4649 | Values: 106.0 115.0 110.0 117.0 114.0 115.0 116.0 114.0 115.0 115.0 13:02:25 INFO - PROCESS | 4649 | 13:02:25 INFO - PROCESS | 4649 | [#1] audio-beat-detection Cycles:10 Average:148.40 Median:155.00 stddev:22.23 (14.3%) stddev-sans-first:23.48 13:02:25 INFO - PROCESS | 4649 | Values: 154.0 124.0 147.0 169.0 132.0 159.0 156.0 127.0 192.0 124.0 13:02:25 INFO - PROCESS | 4649 | 13:02:25 INFO - PROCESS | 4649 | [#2] audio-dft Cycles:10 Average:163.70 Median:163.00 stddev:3.37 (2.1%) stddev-sans-first:3.57 13:02:25 INFO - PROCESS | 4649 | Values: 164.0 162.0 165.0 169.0 170.0 162.0 162.0 162.0 161.0 160.0 13:02:25 INFO - PROCESS | 4649 | 13:02:25 INFO - PROCESS | 4649 | [#3] audio-fft Cycles:10 Average:90.80 Median:76.00 stddev:31.22 (41.1%) stddev-sans-first:32.65 13:02:25 INFO - PROCESS | 4649 | Values: 76.0 75.0 75.0 148.0 76.0 77.0 76.0 76.0 152.0 77.0 13:02:25 INFO - PROCESS | 4649 | 13:02:25 INFO - PROCESS | 4649 | [#4] audio-oscillator Cycles:10 Average:103.80 Median:86.00 stddev:29.77 (34.6%) stddev-sans-first:30.87 13:02:25 INFO - PROCESS | 4649 | Values: 86.0 86.0 162.0 86.0 85.0 87.0 143.0 86.0 85.0 132.0 13:02:25 INFO - PROCESS | 4649 | 13:02:25 INFO - PROCESS | 4649 | [#5] imaging-gaussian-blur Cycles:10 Average:118.20 Median:118.00 stddev:0.42 (0.4%) stddev-sans-first:0.33 13:02:25 INFO - PROCESS | 4649 | Values: 119.0 118.0 118.0 118.0 118.0 118.0 118.0 118.0 119.0 118.0 13:02:25 INFO - PROCESS | 4649 | 13:02:25 INFO - PROCESS | 4649 | [#6] imaging-darkroom Cycles:10 Average:148.70 Median:149.00 stddev:0.95 (0.6%) stddev-sans-first:1.00 13:02:25 INFO - PROCESS | 4649 | Values: 149.0 150.0 147.0 148.0 148.0 149.0 149.0 148.0 150.0 149.0 13:02:25 INFO - PROCESS | 4649 | 13:02:25 INFO - PROCESS | 4649 | [#7] imaging-desaturate Cycles:10 Average:95.70 Median:96.00 stddev:0.67 (0.7%) stddev-sans-first:0.71 13:02:25 INFO - PROCESS | 4649 | Values: 96.0 96.0 95.0 96.0 95.0 96.0 97.0 95.0 96.0 95.0 13:02:25 INFO - PROCESS | 4649 | 13:02:25 INFO - PROCESS | 4649 | [#8] json-parse-financial Cycles:10 Average:68.10 Median:68.50 stddev:2.33 (3.4%) stddev-sans-first:2.22 13:02:25 INFO - PROCESS | 4649 | Values: 71.0 69.0 68.0 67.0 66.0 66.0 67.0 70.0 65.0 72.0 13:02:25 INFO - PROCESS | 4649 | 13:02:25 INFO - PROCESS | 4649 | [#9] json-stringify-tinderbox Cycles:10 Average:66.20 Median:66.00 stddev:0.42 (0.6%) stddev-sans-first:0.44 13:02:25 INFO - PROCESS | 4649 | Values: 66.0 66.0 66.0 66.0 67.0 66.0 66.0 67.0 66.0 66.0 13:02:25 INFO - PROCESS | 4649 | 13:02:25 INFO - PROCESS | 4649 | [#10] stanford-crypto-aes Cycles:10 Average:81.80 Median:83.00 stddev:2.94 (3.5%) stddev-sans-first:3.00 13:02:25 INFO - PROCESS | 4649 | Values: 84.0 80.0 79.0 77.0 79.0 82.0 85.0 83.0 83.0 86.0 13:02:25 INFO - PROCESS | 4649 | 13:02:25 INFO - PROCESS | 4649 | [#11] stanford-crypto-ccm Cycles:10 Average:142.30 Median:142.00 stddev:13.92 (9.8%) stddev-sans-first:13.91 13:02:25 INFO - PROCESS | 4649 | Values: 129.0 132.0 143.0 131.0 141.0 136.0 152.0 136.0 176.0 147.0 13:02:25 INFO - PROCESS | 4649 | 13:02:25 INFO - PROCESS | 4649 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:167.70 Median:168.50 stddev:3.27 (1.9%) stddev-sans-first:3.18 13:02:25 INFO - PROCESS | 4649 | Values: 164.0 173.0 165.0 164.0 165.0 167.0 169.0 172.0 168.0 170.0 13:02:25 INFO - PROCESS | 4649 | 13:02:25 INFO - PROCESS | 4649 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:68.90 Median:69.00 stddev:1.73 (2.5%) stddev-sans-first:1.42 13:02:25 INFO - PROCESS | 4649 | Values: 72.0 68.0 71.0 68.0 68.0 67.0 70.0 70.0 67.0 68.0 13:02:25 INFO - PROCESS | 4649 | -------- Summary: end -------- 13:02:25 INFO - PROCESS | 4649 | 13:02:26 INFO - TEST-INFO | 4649: exit 0 13:02:26 INFO - TEST-OK | kraken | took 64165ms 13:02:26 INFO - SUITE-END | took 1181s 13:02:26 INFO - Completed test suite (00:19:41) 13:02:26 INFO - javascript benchmark 13:02:26 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"extraOptions": ["e10s"], "name": "dromaeo_css", "lowerIsBetter": false, "alertThreshold": 5.0, "value": 6351.503571753554, "subtests": [{"name": "dojo.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [2614.738526147385, 2669.0524863673395, 2698.3389069677933, 2708.6614173228345, 2711.4441539484405, 4853.927191092136, 4855.732934688591, 4873.049755297714, 4909.7545122743895, 4969.751512424383, 4674.55591718787, 4800.735959522225, 4833.589144922677, 4842.66101372904, 4890.437599676038, 4397.34039894016, 4422.447194100738, 4542.182407166709, 4542.909141817162, 4547.499775024761, 654.1356973468511, 4332.84835030774, 4336.197803406364, 4386.2324093283705, 4444.17782710198, 4369.169857727037, 4393.868183954454, 4402.25161722508, 4414.602685758297, 4457.487388950248, 4385.583369579885, 4405.0, 4411.0, 4418.204723149832, 4435.356873253392, 4288.463942007249, 4326.6538676905775, 4364.170807546588, 4367.847125350598, 4424.734515929054, 4703.929441058387, 4749.928751068736, 4784.856454306377, 4787.712737235777, 4855.5872750816225, 5144.665596736238, 5156.0, 5169.457206993249, 5174.741262936838, 5232.529072383504, 5127.589792816603, 5203.19350500673, 5221.765020574083, 5222.164453687392, 5245.134552798783, 4804.591609713144, 4847.369841920563, 4848.975755121237, 4875.049365373789, 4898.853034408973, 5118.564921981673, 5265.4997775211295, 5353.892922141536, 5356.357237131491, 5370.91943620846, 5060.696358218519, 5100.974495127575, 5129.8717532061255, 5133.717645529532, 5167.896642067213, 5201.0, 5201.921971170435, 5206.609504287194, 5214.739263036833, 5261.736913154327, 5015.523525265094, 5056.6713163644245, 5091.287219789232, 5168.121419358718, 5169.974150129226, 5079.238114282887, 5091.490850914953, 5096.184610462383, 5102.744862756847, 5146.87132821675, 4419.513853476115, 4422.049259409242, 4422.469303683579, 4432.29083346663, 4449.13241917823, 3802.657760801486, 3807.923841523154, 3843.788591627487, 3844.500214972036, 3872.341701910682, 4327.264365057885, 4403.735775853459, 4473.552644735565, 4485.035717320791, 4515.525869783691, 5277.973610131925, 5286.524212820865, 5305.36335639718, 5305.389880163753, 5361.383440904268, 4304.504981927056, 4434.290513517886, 4467.977660111744, 4478.7760611969925, 4514.706544074625, 4742.359781429532, 4746.169420351424, 4750.0, 4751.3348131261655, 4794.808207671654, 4838.927416088762, 4924.335214746106, 4944.777485013111, 4945.505449455098, 4965.4289756678445, 5097.898042039213, 5152.124138896322, 5154.7938082477785, 5157.045946499909, 5181.404138524118, 4825.059113472839, 4830.082284365959, 4844.46710861812, 4845.030993801324, 4886.193778026728, 5045.949540504548, 5092.923606145837, 5098.974505127599, 5102.515261050195, 5144.382674079135, 5226.189940559219, 5229.555487783581, 5285.973570132125, 5305.31030965972, 5331.333583302087, 5159.561437277724, 5176.922346164886, 5184.351956005499, 5194.298769666047, 5238.240455133908, 4971.328870602422, 5029.497050294941, 5104.285400044071, 5147.356580427447, 5162.612804039637, 4993.700377977333, 5007.899842003067, 5015.322931404359, 5059.089363914531, 5076.949230507647, 5151.639385242997, 5170.146925757208, 5173.094708426086, 5174.275601415729, 5220.608454366014, 4841.757912104451, 4892.68197567157, 4954.826581069645, 5029.5221953914315, 5029.748512574283], "value": 4732.75853026637, "unit": "score"}, {"name": "ext.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [548.7942021741846, 550.444051507977, 557.4509108528099, 569.5358282999355, 590.7784580782206, 35066.47400288995, 39848.40227396591, 39901.2019759605, 39914.40128398076, 39962.40056399156, 39743.20513589727, 40104.19791604166, 40309.59690403095, 40343.19313613726, 40387.39418908719, 7775.533467991911, 7960.164182760814, 8008.879866802003, 8018.0779210390965, 8031.518108913455, 7998.64006119726, 8011.519308841459, 8077.030756309251, 8090.878636820423, 8091.0, 8120.6345714443, 8128.268455838974, 8141.43009989301, 8163.836723265531, 8180.918190818105, 7985.321247693953, 8014.799630009296, 8054.7180848670305, 8068.757937261891, 8095.7166499172545, 7937.0, 8054.355651547862, 8056.073551541531, 8057.59712014397, 8076.959615201887, 38655.42016869749, 39050.60949390498, 39066.80466597649, 39070.60929390698, 39103.60896391028, 2680.5175068487665, 2981.6272965879266, 3159.273367125551, 3189.5056266278766, 3268.2319654881085, 25840.612390814153, 27070.05254816092, 28023.439531209464, 28344.291392715142, 28622.713772862215, 3198.104530731399, 3211.6306624737986, 3225.3065590897836, 3264.2329052672603, 3326.06870076379, 226220.0, 226509.0, 227926.0, 228771.0, 228810.0, 32624.347513049604, 32657.83671081677, 32860.50709239364, 33644.49533257003, 33677.494837577455, 33993.49009764855, 34152.658473415446, 34233.657663423546, 34385.140371490415, 34395.0, 13976.371063301973, 14072.437102515989, 14094.295285235903, 14097.506587269396, 14127.0, 11319.151063670257, 11383.943080284545, 11387.544498219979, 11442.027427668741, 11443.9128282813, 7834.569098699626, 7927.722529711433, 8002.679892804339, 8041.3164880984605, 8044.477108987897, 3034.8027378220345, 3073.615798025247, 3076.215565030903, 3083.105899289181, 3120.2199450137464, 862.7109918177481, 886.7650072730731, 889.2485849457198, 1021.1167340250778, 1040.6825918095053, 28817.0, 29492.115236542937, 29691.406171876442, 29797.404051918842, 30026.39947201044, 937.8030613571226, 960.901754019109, 965.3146266151111, 978.1294647763497, 999.1914634511558, 14537.418503259963, 14804.241435562702, 14835.47796874534, 14837.406503739945, 15289.6177595561, 391415.0, 395488.0, 397624.0, 397957.0, 398579.0, 50283.74858125759, 50604.0, 51059.0, 51093.74453127711, 51304.743476283125, 1089.2974031749477, 1102.7573933734566, 1165.6969188011178, 1174.976500470003, 1232.87671232876, 26744.331391715365, 27960.30099247454, 28281.0, 28560.0, 28820.855895720386, 42692.359614605186, 43554.78222608867, 43582.56417435785, 43593.12813743771, 43620.56379436165, 270953.0, 273607.0, 275476.0, 275903.0, 276150.0, 25686.229413117635, 25873.76577927759, 25877.87061064758, 26133.869330653226, 26214.73785262123, 42560.935976600835, 43414.782926085165, 43539.346909797016, 43921.121577568905, 44485.0, 37538.624613754604, 37583.2483350326, 37775.0, 37970.24059518739, 38047.0, 37033.81483092675, 37076.81461592675, 37174.0, 37344.0, 37406.812965934994, 31364.37271254608, 36014.27971440609, 36230.45654315135, 36297.81851090727, 37532.43701344427, 32288.83855580707, 32992.0, 33298.33403331968, 33604.0, 33724.662753372155, 25583.0, 25930.67270722187, 26189.0, 26246.60630090512, 26270.080547181522], "value": 16354.113104189899, "unit": "score"}, {"name": "jquery.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [377.7733359984009, 381.89497888080774, 383.3463943975522, 383.8790780904016, 393.1645253835599, 16923.661526769472, 17253.309867605298, 17414.82585174148, 18229.17968691409, 18239.544011399707, 10564.947175264113, 10646.520906559204, 10895.400752958583, 10920.344779313247, 10943.83584246237, 4715.43414790224, 4736.739479328636, 4753.16819556578, 4756.310335001423, 4786.71279723216, 4668.603168730645, 4694.765261736899, 4720.433547974248, 4728.1252968201, 4742.502037286087, 4696.788644511005, 4708.034852855174, 4714.175019371613, 5178.7928482860825, 5368.0, 5413.648112872651, 5476.835694929158, 5488.7530061147345, 5510.7049843286995, 5511.311086114236, 5178.249153872705, 5273.736313184326, 5281.494773989433, 5323.600729945269, 5353.732313384316, 13252.138610990254, 13276.203427794364, 13436.0, 13957.58127256184, 21993.780062199334, 1948.6492431362349, 1953.5995121000303, 1992.8405727541763, 2082.8125468707735, 2485.3165379520597, 9073.63705451781, 9815.411075335503, 10052.748681282954, 10121.443320617363, 10133.949330253301, 1800.1179422083217, 1821.3443160462223, 1822.2255541394854, 1840.9631807363778, 1863.5620629152138, 52503.47496525024, 67180.0, 68269.65865170643, 71805.64097179534, 73643.0, 9911.553980070914, 9965.40207587547, 10174.796504070026, 10269.178465722724, 10405.27163098591, 13754.31228438574, 13836.515721949683, 13853.307334633228, 13898.791518127236, 13902.16587004783, 7425.591592462359, 7455.669196524511, 7508.0, 7555.433342499225, 7698.923010769932, 7172.964135179291, 7237.240089790496, 7489.400847932152, 7645.503042302233, 7684.9615751922, 4185.895352616209, 4330.0, 4340.370646256339, 4399.5380485049245, 4547.454305483363, 1789.7941736700186, 1819.3177558415593, 1841.3555255660679, 1867.318428773488, 1872.7939926608062, 834.7412302186342, 844.3582877013391, 858.3862538285031, 860.6772460327377, 898.6405437824923, 17343.21955512005, 17880.55298617519, 18166.455006349832, 18199.45401637953, 18264.17811198499, 867.8784970104191, 873.7116751472126, 877.3025444771422, 881.9294456443469, 882.9867551986725, 7542.886856697154, 9918.553665085088, 9923.0, 9925.1067403934, 9997.250206234561, 374957.0, 375267.0, 383470.0, 394721.0, 398744.0, 81087.59456202682, 83603.5819820897, 84547.15452845515, 84622.0, 84698.15301846902, 884.3544212724747, 899.7300809757178, 900.7477906186148, 913.456493386434, 919.544825311475, 15734.685306294039, 15901.363945442054, 16045.438409655606, 16088.276027578553, 16148.0, 35660.64339356677, 37268.0, 38646.22707545777, 39747.60252397439, 40328.193436130525, 51332.74333628308, 53217.20174197468, 53421.0, 53867.73066134644, 54672.17991730207, 6555.573887697285, 6767.796966091025, 7843.234577337752, 8116.2695357418115, 8173.386995975206, 10322.896771032194, 10820.89179108199, 11178.161637877029, 11290.096792256763, 11303.491342889425, 7817.983662124115, 9580.808383832424, 10034.598616055568, 10094.8485772712, 10318.690439286833, 4533.0, 6410.519211059096, 8611.6985905493, 9657.420554766737, 9677.080677335642, 5137.743112844268, 6128.66292353907, 8408.654615261528, 9650.662226822027, 10071.647492337734, 6937.306269373023, 7052.717891284291, 7124.251953544803, 7163.6060016699585, 7172.318629730167, 9840.11438970496, 9845.655402060893, 9897.604095836086, 10015.449150296512, 10039.397636141855], "value": 7927.756336131629, "unit": "score"}, {"name": "mootools.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [1315.1057281048886, 1392.637914142323, 1393.707321462493, 1682.3775203174828, 1700.4643537285763, 6895.5173137880365, 7515.849683006337, 7586.658600362983, 8098.473599216047, 8102.0, 7501.774946751606, 7660.4254680898875, 7836.804079897991, 7868.567228802413, 7873.37013038957, 2153.3647573965677, 2199.3292045925987, 2209.6795964585126, 2214.0922221889027, 2223.6442169252923, 2141.7001619773246, 2166.80498755112, 2208.7901649343285, 2211.9889400552975, 2213.6679498075255, 2084.8644838085474, 2094.581083783242, 2100.9264675736354, 2131.8507704460694, 2215.601191785478, 2193.013144085152, 2194.3416974907464, 2199.076387917071, 2205.151016858505, 2208.59141058903, 2052.9794702052936, 2142.1110239250693, 2147.3235930681785, 2150.763416024236, 2155.967660485094, 7873.291403773688, 7902.407319451064, 7907.209279072104, 7917.168697286817, 7919.0, 4759.7620118994255, 4857.417109946794, 4870.561649451566, 4873.049755297683, 4882.218844984821, 2902.4630443368046, 2904.5788360687584, 2927.0779704393262, 3010.8494575271366, 3019.9547006794915, 858.0347109501811, 866.1728049712509, 877.1886005444937, 880.8370451466435, 911.2937473458123, 10846.783064338748, 10873.619423320224, 10900.563977440894, 10901.509432075576, 10928.781424371467, 4089.9386509202386, 4200.222958752641, 4308.46144231971, 4313.870583882489, 4331.263685173528, 9211.861822072675, 9227.307951903635, 9264.11990860867, 9278.0, 9303.209227215762, 4833.975830120898, 4834.927476087862, 4839.854804355875, 4861.80552777892, 4877.170880950247, 3763.3414152523746, 4275.123599662062, 4416.425864637641, 4432.512423633398, 4438.889027774331, 3736.1033351995325, 3779.9244015119543, 3844.3272427325664, 3852.8844134676006, 3889.611038896088, 1206.740550781586, 1234.925904445736, 1235.2897084176634, 1236.0914727675151, 1237.5173682263924, 809.6558962440939, 823.3331001888489, 830.8919840420707, 870.5995242188537, 871.5119533061505, 5253.238280449314, 5285.524302812689, 5337.306150200527, 5381.19282107687, 5409.918851217235, 399.8800359892021, 401.345806335671, 409.25107054091535, 413.4088253797099, 416.09914535031925, 3705.073731567108, 3744.4944932433773, 3834.789086600208, 3907.648311651965, 4193.245215861174, 9900.306978511435, 10029.0, 10110.595576177018, 10112.342697724624, 10122.746931326776, 9822.26333025026, 9916.107550320507, 9948.651797187063, 9951.701448956543, 9961.352512086836, 7433.479656424107, 7473.476856619985, 7679.6160191990175, 7689.76930692069, 7717.6527056281475, 5649.4633009864, 5660.632058916157, 5740.138979152994, 5843.795467158629, 5856.648601083949, 9151.725448236564, 9289.62841486333, 9482.19401350893, 9529.0, 9531.52342382892, 9244.815103697754, 9357.953210233905, 9404.905950940676, 9405.952970235105, 9522.85715714251, 6244.65654389013, 6756.628385438848, 7002.439804815501, 7012.894806577803, 7201.963990180225, 7751.302382785577, 7752.108507521707, 7781.0, 7801.297883190313, 7856.646450909609, 6734.898976515454, 6837.145356830396, 6890.931090689029, 6987.895181572178, 7013.368796808311, 6736.393724564813, 6827.692753825991, 6918.446524278146, 7002.474814388839, 7045.260247674126, 6327.145835312174, 6332.145160403286, 6360.236771587439, 6364.4908407326375, 6403.743850246125, 4482.0, 4507.819687212606, 4553.3397657340165, 4612.630989520897, 4637.489876113557, 4639.164950308977, 4696.225122854691, 4753.0256297458245, 4768.284757286435, 4796.664233503621], "value": 4143.311618775456, "unit": "score"}, {"name": "prototype.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [307.87992682853684, 310.11616891858205, 313.78662509493535, 315.43222200039924, 318.33309217189986, 5101.311322971398, 5131.12770828959, 5135.614828887839, 5143.254228136918, 5151.536361727443, 5022.0, 5025.874353141174, 5039.395272567288, 5042.394912610483, 5044.84865454036, 3739.1026153723046, 3887.0, 3981.0, 3992.760434373932, 3999.4200840878057, 3966.4645272888224, 3976.582458841823, 3982.1438390745984, 3982.7411218270718, 3992.341263691502, 3958.1687845552324, 3964.345882929313, 3972.880813575597, 3973.1060511384994, 3977.880663580097, 3703.6111208323277, 3917.275304068728, 3920.2355540669582, 3974.741641793274, 3985.3822657488136, 3422.1273575238406, 3429.3141371725756, 3429.794212347267, 3436.432988556885, 3440.2947395784054, 4922.483139270361, 4927.581155601778, 4934.555889969884, 4940.135476291634, 4945.579625731817, 4251.277282861921, 4485.394471746337, 4493.236149854532, 4500.572445617661, 4505.0, 5309.0, 5311.814086506954, 5318.0, 5327.575952941403, 5328.094223981893, 3745.7752534847996, 3754.342989976743, 3755.75587586806, 3765.190484045916, 3774.67915227206, 5332.813351532716, 5527.115661494142, 5537.418571050022, 5554.666719996772, 5557.5831812614215, 3779.7543159694533, 3828.789416582115, 3844.2695887781233, 3846.3845784674318, 3860.4595356650093, 3859.2474467478573, 3873.65137137659, 3888.3778595424596, 3897.317969355408, 3906.316394630985, 4434.733915965053, 4449.174774018456, 4456.131054444417, 4463.397441345442, 4470.9105817883465, 5166.3025491558155, 5252.212168174804, 5289.831169220601, 5306.416294207634, 5325.973370133124, 1331.6937104465833, 1338.9330533473287, 1344.193483909666, 1346.6835293705972, 1357.151780137414, 842.5239739547136, 843.9029511606121, 865.3077537969599, 865.9220670139717, 894.7181637784207, 4578.88552786183, 4595.770211489412, 4614.723116613014, 4622.214223581999, 4625.814967401334, 5360.70516121617, 5390.21841832932, 5400.594955378362, 5411.269478620415, 5434.83695489136, 4448.288273876229, 4531.207038768202, 4579.0, 4592.494825569184, 4604.769761511911, 2870.9138725838257, 2875.0, 2882.0633294179056, 2897.1887871396043, 2902.941941161207, 5049.798008079636, 5055.6713813602, 5069.695818250917, 5073.239014147907, 5078.21287700407, 5261.657992230493, 5459.66238271626, 5518.696471694096, 5528.198411230349, 5531.119419397424, 5013.849584512471, 5030.48475762119, 5034.169362055293, 5043.773030213576, 5047.520485553867, 5388.488093631099, 5399.7300134993875, 5402.162664786964, 5419.783208671609, 5424.891502170013, 5045.445001049955, 5269.4730526947, 5290.338707661543, 5291.470852914677, 5328.493793089805, 5060.9381324298265, 5074.213496907985, 5074.904308371964, 5080.263361812443, 5082.288479612931, 3806.333891568909, 3819.9236015280094, 3830.4445855351373, 3831.731778775459, 3835.175437280998, 5209.583233341399, 5324.3910483861855, 5353.544948679406, 5381.27352807366, 5386.7575959082715, 5226.8954620908125, 5255.527002569787, 5262.421133675216, 5264.789408423773, 5271.815486457956, 5250.527452529291, 5251.6323857331145, 5252.632315738015, 5265.657732247391, 5271.20931860224, 4958.256261560795, 5166.199239117943, 5181.3005244291535, 5192.0, 5195.506426889439, 5101.566366858859, 5174.741262936914, 5266.131088370376, 5328.920066198933, 5358.571314294769, 5188.403333616682, 5204.791808327776, 5209.47905209476, 5212.739363031909, 5222.817201397933], "value": 3963.8432660259646, "unit": "score"}, {"name": "yui.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [653.4902775834845, 655.3937607712865, 724.6594100772638, 742.2651574940809, 758.2417582417582, 12756.617301480946, 12932.418041188146, 13038.217706937567, 13405.262710550916, 13800.861991380083, 12953.805692914613, 13001.479940802381, 13040.282784446852, 13053.151545149582, 13056.608301750939, 634.0964126120283, 779.4154384211841, 781.980450488738, 797.1709422200904, 800.8718605023197, 784.9882251766228, 794.3287921706178, 797.4656979823503, 797.4696826610298, 799.1968072087544, 850.5449584472309, 851.5742128935532, 852.075498084579, 854.0306751836648, 854.8845905802731, 834.845553572591, 838.7609531283555, 843.7679638099542, 844.3625063077337, 844.4511067805914, 614.9944840186283, 615.9106929495243, 616.5345164400893, 616.9907451388233, 618.2395653346364, 13639.386227619781, 13814.93092534541, 13816.723665526733, 13875.098118622258, 13945.721085578332, 13356.532521361803, 13404.86595134046, 13611.0, 13721.45114195441, 13918.443262269497, 8866.55667216643, 9141.588628511732, 9155.725328240163, 9205.401648892801, 9211.217046551052, 3272.1001724525945, 3333.749968752329, 3348.380549598308, 3348.8325583720716, 3414.3000684859544, 70158.29841701569, 70938.29061709369, 71734.0, 72249.27750722478, 72307.0, 10422.322549034288, 10604.310719803343, 11102.777944441066, 11145.331280123219, 11225.101991840633, 19773.60452790965, 19833.60332793336, 19955.900220499094, 19991.20035198605, 20020.099095540736, 6326.620402775849, 6550.181227346582, 6559.737610495622, 6664.400203981665, 6835.453163746888, 3571.4107172316276, 3627.1657518770303, 3650.3976843821, 3729.5524537055185, 3766.322062028861, 2777.0835624244355, 2867.655881294258, 2888.205743420534, 2894.72500112489, 2912.796104272723, 487.3497503697352, 494.6438564233746, 497.51989330296436, 497.8605990322715, 499.59532778449574, 542.7747484793766, 556.629841155627, 557.4258513730864, 565.0958466453724, 574.6523353371234, 7169.0, 7184.49708520409, 7354.970304157422, 7364.079490063742, 7510.248975102555, 523.6203752279566, 528.4715284715285, 537.6800803521899, 551.9724013799294, 553.335996803837, 3506.2111025019167, 3523.9119022024142, 3525.94711079334, 3559.0746405934124, 3654.8903532894055, 84143.5792821032, 93524.53237733767, 94534.0, 98488.50755746319, 99385.50307248418, 82342.0, 82974.58512707398, 83209.0, 83318.58340708379, 85172.0, 46116.3082553762, 56712.716436417555, 74597.0, 76121.0, 76672.0, 6883.670758382414, 7142.857142857218, 7151.82120446993, 7179.210286868336, 8075.232852878967, 37667.73993560395, 43615.781921090194, 44268.7786561078, 44422.55577444184, 45941.08117837692, 43694.34458483189, 46854.0, 64486.67756661187, 64726.67636661787, 64891.67554162199, 11034.393108379116, 11177.72055698614, 11453.828192576952, 11460.598879039528, 11760.58837940668, 11958.58144964922, 12712.618621441372, 13033.934830325788, 13094.869051309364, 13699.931500342833, 10861.185411094357, 11930.403479826147, 12347.259164450163, 12790.61628151157, 13028.088033837541, 12132.272063676208, 12328.383580820744, 12355.75288494243, 12486.750264994831, 12879.549215777402, 10300.845487317547, 11162.776744465227, 12148.696282592653, 12251.142420030512, 12314.384280785745, 9315.161635452841, 10208.54061567246, 10211.948940255252, 10330.380177189092, 10398.896011039793, 10140.847887281845, 10426.113780328757, 10592.470376481298, 10619.734506637396, 10657.827638959554], "value": 6514.179058964936, "unit": "score"}]}, {"extraOptions": ["e10s"], "name": "kraken", "lowerIsBetter": true, "alertThreshold": 2.0, "value": 1578.0, "subtests": [{"name": "ai-astar", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [106.0, 115.0, 110.0, 117.0, 114.0, 115.0, 116.0, 114.0, 115.0, 115.0], "value": 113.7, "unit": "score"}, {"name": "audio-beat-detection", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [154.0, 124.0, 147.0, 169.0, 132.0, 159.0, 156.0, 127.0, 192.0, 124.0], "value": 148.4, "unit": "score"}, {"name": "audio-dft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [164.0, 162.0, 165.0, 169.0, 170.0, 162.0, 162.0, 162.0, 161.0, 160.0], "value": 163.7, "unit": "score"}, {"name": "audio-fft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [76.0, 75.0, 75.0, 148.0, 76.0, 77.0, 76.0, 76.0, 152.0, 77.0], "value": 90.8, "unit": "score"}, {"name": "audio-oscillator", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [86.0, 86.0, 162.0, 86.0, 85.0, 87.0, 143.0, 86.0, 85.0, 132.0], "value": 103.8, "unit": "score"}, {"name": "imaging-gaussian-blur", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [119.0, 118.0, 118.0, 118.0, 118.0, 118.0, 118.0, 118.0, 119.0, 118.0], "value": 118.2, "unit": "score"}, {"name": "imaging-darkroom", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [149.0, 150.0, 147.0, 148.0, 148.0, 149.0, 149.0, 148.0, 150.0, 149.0], "value": 148.7, "unit": "score"}, {"name": "imaging-desaturate", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [96.0, 96.0, 95.0, 96.0, 95.0, 96.0, 97.0, 95.0, 96.0, 95.0], "value": 95.7, "unit": "score"}, {"name": "json-parse-financial", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [71.0, 69.0, 68.0, 67.0, 66.0, 66.0, 67.0, 70.0, 65.0, 72.0], "value": 68.1, "unit": "score"}, {"name": "json-stringify-tinderbox", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [66.0, 66.0, 66.0, 66.0, 67.0, 66.0, 66.0, 67.0, 66.0, 66.0], "value": 66.2, "unit": "score"}, {"name": "stanford-crypto-aes", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [84.0, 80.0, 79.0, 77.0, 79.0, 82.0, 85.0, 83.0, 83.0, 86.0], "value": 81.8, "unit": "score"}, {"name": "stanford-crypto-ccm", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [129.0, 132.0, 143.0, 131.0, 141.0, 136.0, 152.0, 136.0, 176.0, 147.0], "value": 142.3, "unit": "score"}, {"name": "stanford-crypto-pbkdf2", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [164.0, 173.0, 165.0, 164.0, 165.0, 167.0, 169.0, 172.0, 168.0, 170.0], "value": 167.7, "unit": "score"}, {"name": "stanford-crypto-sha256-iterative", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [72.0, 68.0, 71.0, 68.0, 68.0, 67.0, 70.0, 70.0, 67.0, 68.0], "value": 68.9, "unit": "score"}]}]} 13:02:27 INFO - Return code: 0 13:02:27 INFO - Validating PERFHERDER_DATA against /builds/slave/test/scripts/external_tools/performance-artifact-schema.json 13:02:27 ERROR - # TBPL SUCCESS # 13:02:27 INFO - Running post-action listener: _resource_record_post_action 13:02:27 INFO - ##### 13:02:27 INFO - ##### Finished run-tests step (success) 13:02:27 INFO - ##### 13:02:27 INFO - Running post-run listener: _resource_record_post_run 13:02:27 INFO - Total resource usage - Wall time: 1198s; CPU: 13.0%; Read bytes: 630784; Write bytes: 286146560; Read time: 136; Write time: 208048 13:02:27 INFO - TinderboxPrint: CPU usage
13.3% 13:02:27 INFO - TinderboxPrint: I/O read bytes / time
630,784 / 136 13:02:27 INFO - TinderboxPrint: I/O write bytes / time
286,146,560 / 208,048 13:02:27 INFO - TinderboxPrint: CPU idle
8,287.9 (86.7%) 13:02:27 INFO - TinderboxPrint: CPU user
1,218.5 (12.7%) 13:02:27 INFO - TinderboxPrint: Swap in / out
0 / 0 13:02:27 INFO - install - Wall time: 17s; CPU: 13.0%; Read bytes: 0; Write bytes: 679936; Read time: 0; Write time: 56 13:02:27 INFO - run-tests - Wall time: 1182s; CPU: 13.0%; Read bytes: 626688; Write bytes: 285466624; Read time: 136; Write time: 207992 13:02:27 INFO - Running post-run listener: _upload_blobber_files 13:02:27 INFO - Blob upload gear active. 13:02:27 INFO - Preparing to upload files from /builds/slave/test/build/blobber_upload_dir. 13:02:27 INFO - Files from /builds/slave/test/build/blobber_upload_dir are to be uploaded with branch at the following location(s): https://blobupload.elasticbeanstalk.com 13:02:27 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/venv/bin/blobberc.py', '-u', 'https://blobupload.elasticbeanstalk.com', '-a', '/builds/slave/test/oauth.txt', '-b', 'Autoland-Non-PGO', '-d', '/builds/slave/test/build/blobber_upload_dir', '--output-manifest', '/builds/slave/test/build/uploaded_files.json'] 13:02:27 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/venv/bin/blobberc.py -u https://blobupload.elasticbeanstalk.com -a /builds/slave/test/oauth.txt -b Autoland-Non-PGO -d /builds/slave/test/build/blobber_upload_dir --output-manifest /builds/slave/test/build/uploaded_files.json 13:02:28 INFO - (blobuploader) - INFO - Open directory for files ... 13:02:28 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log ... 13:02:28 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 13:02:28 INFO - (blobuploader) - INFO - Uploading, attempt #1. 13:02:28 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_errorsummary.log: uploaded 13:02:28 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 13:02:28 INFO - (blobuploader) - INFO - Done attempting. 13:02:28 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log ... 13:02:28 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 13:02:28 INFO - (blobuploader) - INFO - Uploading, attempt #1. 13:02:29 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_raw.log: uploaded 13:02:29 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 13:02:29 INFO - (blobuploader) - INFO - Done attempting. 13:02:29 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/resource-usage.json ... 13:02:29 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 13:02:29 INFO - (blobuploader) - INFO - Uploading, attempt #1. 13:02:37 INFO - (blobuploader) - INFO - TinderboxPrint: resource-usage.json: uploaded 13:02:37 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 13:02:37 INFO - (blobuploader) - INFO - Done attempting. 13:02:37 INFO - (blobuploader) - INFO - Iteration through files over. 13:02:37 INFO - Return code: 0 13:02:37 INFO - rmtree: /builds/slave/test/build/uploaded_files.json 13:02:37 INFO - retry: Calling remove with args: ('/builds/slave/test/build/uploaded_files.json',), kwargs: {}, attempt #1 13:02:37 INFO - Setting buildbot property blobber_files to {"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Autoland-Non-PGO/sha512/180ab39ef1870f4fd46fc7bebe7cea8a03fbc347f15264df42bace77f3e3de8fa166c6936f2150799bb0850d570107706e90af9d528ffdf4bbc08ee130d9e84d", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Autoland-Non-PGO/sha512/84c7c60d02cdfb8356f247731f1adcef7a1d93f5f72c34c03ccd48534f183909c5e617adb85f56d068b2b8f800f2e65cead00e5dfac5e79e063e85f2e5c4213d", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Autoland-Non-PGO/sha512/0cda84691c2f85e7cb105b377b62352ee5eaaefc51a0815f69eb060851b87b26270cc2a5acc55eb6c0df8cb12f94dbf701773b7294f5f8f319c486db7d82d457"} 13:02:37 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test/properties/blobber_files 13:02:37 INFO - Writing to file /builds/slave/test/properties/blobber_files 13:02:37 INFO - Contents: 13:02:37 INFO - blobber_files:{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Autoland-Non-PGO/sha512/180ab39ef1870f4fd46fc7bebe7cea8a03fbc347f15264df42bace77f3e3de8fa166c6936f2150799bb0850d570107706e90af9d528ffdf4bbc08ee130d9e84d", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Autoland-Non-PGO/sha512/84c7c60d02cdfb8356f247731f1adcef7a1d93f5f72c34c03ccd48534f183909c5e617adb85f56d068b2b8f800f2e65cead00e5dfac5e79e063e85f2e5c4213d", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Autoland-Non-PGO/sha512/0cda84691c2f85e7cb105b377b62352ee5eaaefc51a0815f69eb060851b87b26270cc2a5acc55eb6c0df8cb12f94dbf701773b7294f5f8f319c486db7d82d457"} 13:02:37 INFO - Running post-run listener: copy_logs_to_upload_dir 13:02:37 INFO - Copying logs to upload dir... 13:02:37 INFO - mkdir: /builds/slave/test/build/upload/logs 13:02:37 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1241.053685 ========= master_lag: 40.56 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 21 mins, 21 secs) (at 2016-07-15 13:03:18.398716) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 17 secs) (at 2016-07-15 13:03:18.402518) ========= 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=78329bfc0fd5309db0a6e0ac000001b4-1468611714.282342-933020576 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False blobber_files:{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Autoland-Non-PGO/sha512/180ab39ef1870f4fd46fc7bebe7cea8a03fbc347f15264df42bace77f3e3de8fa166c6936f2150799bb0850d570107706e90af9d528ffdf4bbc08ee130d9e84d", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Autoland-Non-PGO/sha512/84c7c60d02cdfb8356f247731f1adcef7a1d93f5f72c34c03ccd48534f183909c5e617adb85f56d068b2b8f800f2e65cead00e5dfac5e79e063e85f2e5c4213d", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Autoland-Non-PGO/sha512/0cda84691c2f85e7cb105b377b62352ee5eaaefc51a0815f69eb060851b87b26270cc2a5acc55eb6c0df8cb12f94dbf701773b7294f5f8f319c486db7d82d457"} build_url:https://queue.taskcluster.net/v1/task/R58PZ5OhTAuOTpOKUDg9Dw/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 program finished with exit code 0 elapsedTime=0.011235 build_url: 'https://queue.taskcluster.net/v1/task/R58PZ5OhTAuOTpOKUDg9Dw/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2' blobber_files: '{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Autoland-Non-PGO/sha512/180ab39ef1870f4fd46fc7bebe7cea8a03fbc347f15264df42bace77f3e3de8fa166c6936f2150799bb0850d570107706e90af9d528ffdf4bbc08ee130d9e84d", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Autoland-Non-PGO/sha512/84c7c60d02cdfb8356f247731f1adcef7a1d93f5f72c34c03ccd48534f183909c5e617adb85f56d068b2b8f800f2e65cead00e5dfac5e79e063e85f2e5c4213d", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Autoland-Non-PGO/sha512/0cda84691c2f85e7cb105b377b62352ee5eaaefc51a0815f69eb060851b87b26270cc2a5acc55eb6c0df8cb12f94dbf701773b7294f5f8f319c486db7d82d457"}' ========= master_lag: 17.31 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 17 secs) (at 2016-07-15 13:03:35.721050) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-07-15 13:03:35.721347) ========= 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=78329bfc0fd5309db0a6e0ac000001b4-1468611714.282342-933020576 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004564 ========= master_lag: 0.23 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-07-15 13:03:35.958867) ========= ========= Started reboot skipped (results: 3, elapsed: 2 secs) (at 2016-07-15 13:03:35.959134) ========= ========= Finished reboot skipped (results: 3, elapsed: 2 secs) (at 2016-07-15 13:03:38.019055) ========= ========= Total master_lag: 58.16 =========