builder: fx-team_ubuntu64_hw_test-dromaeojs-e10s-pgo slave: talos-linux64-ix-038 starttime: 1470848498.38 results: success (0) buildid: 20160810083014 builduid: 7a24fc98c0f14960957fdefdcd3a16d9 revision: 531100c1d950c8857dda172573fbd23360f7619b ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2016-08-10 10:01:38.378323) ========= master: http://buildbot-master104.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2016-08-10 10:01:38.378765) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-08-10 10:01:38.379045) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-08-10 10:01:38.399072) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-08-10 10:01:38.399482) ========= 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=8783db0840cc980e80bb0bd400000236-1470848496.927111-1403802561 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2016-08-10 10:01:38-- https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py Resolving hg.mozilla.org (hg.mozilla.org)... 63.245.215.25, 63.245.215.102 Connecting to hg.mozilla.org (hg.mozilla.org)|63.245.215.25|:443... connected. HTTP request sent, awaiting response... 200 Script output follows Length: 12141 (12K) [text/x-python] Saving to: `archiver_client.py' 0K .......... . 100% 270K=0.04s 2016-08-10 10:01:38 (270 KB/s) - `archiver_client.py' saved [12141/12141] program finished with exit code 0 elapsedTime=0.143286 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-08-10 10:01:38.556893) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-08-10 10:01:38.557241) ========= 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=8783db0840cc980e80bb0bd400000236-1470848496.927111-1403802561 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.014913 ========= master_lag: 0.04 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-08-10 10:01:38.607345) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-08-10 10:01:38.607733) ========= bash -c 'python archiver_client.py mozharness --repo integration/fx-team --rev 531100c1d950c8857dda172573fbd23360f7619b --destination scripts --debug' in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', u'python archiver_client.py mozharness --repo integration/fx-team --rev 531100c1d950c8857dda172573fbd23360f7619b --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=8783db0840cc980e80bb0bd400000236-1470848496.927111-1403802561 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2016-08-10 10:01:39,109 truncating revision to first 12 chars 2016-08-10 10:01:39,109 Setting DEBUG logging. 2016-08-10 10:01:39,110 attempt 1/10 2016-08-10 10:01:39,110 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/integration/fx-team/531100c1d950?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2016-08-10 10:01:39,417 unpacking tar archive at: fx-team-531100c1d950/testing/mozharness/ program finished with exit code 0 elapsedTime=0.643110 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-08-10 10:01:39.265316) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-08-10 10:01:39.265618) ========= script_repo_revision: 531100c1d950c8857dda172573fbd23360f7619b ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-08-10 10:01:39.266063) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-08-10 10:01:39.266344) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-08-10 10:01:39.276516) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 30 secs) (at 2016-08-10 10:01:39.276858) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Fx-Team --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Fx-Team in dir /builds/slave/test/. (timeout 3600 secs) (maxTime 7200 secs) watching logfiles {} argv: ['/tools/buildbot/bin/python', 'scripts/scripts/talos_script.py', '--suite', 'dromaeojs-e10s', '--add-option', '--webServer,localhost', '--branch-name', 'Fx-Team', '--cfg', 'talos/linux_config.py', '--download-symbols', 'ondemand', '--use-talos-json', '--blob-upload-branch', 'Fx-Team'] 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=8783db0840cc980e80bb0bd400000236-1470848496.927111-1403802561 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 10:01:39 INFO - MultiFileLogger online at 20160810 10:01:39 in /builds/slave/test 10:01:39 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Fx-Team --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Fx-Team 10:01:39 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 10:01:39 INFO - {'append_to_log': False, 10:01:39 INFO - 'base_work_dir': '/builds/slave/test', 10:01:39 INFO - 'blob_upload_branch': 'Fx-Team', 10:01:39 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 10:01:39 INFO - 'branch': 'Fx-Team', 10:01:39 INFO - 'buildbot_json_path': 'buildprops.json', 10:01:39 INFO - 'config_files': ('talos/linux_config.py',), 10:01:39 INFO - 'default_actions': ('clobber', 10:01:39 INFO - 'read-buildbot-config', 10:01:39 INFO - 'download-and-extract', 10:01:39 INFO - 'populate-webroot', 10:01:39 INFO - 'create-virtualenv', 10:01:39 INFO - 'install', 10:01:39 INFO - 'run-tests'), 10:01:39 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 10:01:39 INFO - 'download_minidump_stackwalk': True, 10:01:39 INFO - 'download_symbols': 'ondemand', 10:01:39 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 10:01:39 INFO - 'tooltool.py': '/tools/tooltool.py', 10:01:39 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 10:01:39 INFO - '/tools/misc-python/virtualenv.py')}, 10:01:39 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 10:01:39 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 10:01:39 INFO - 'installer_path': 'installer.exe', 10:01:39 INFO - 'log_level': 'info', 10:01:39 INFO - 'log_name': 'talos', 10:01:39 INFO - 'log_to_console': True, 10:01:39 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 10:01:39 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 10:01:39 INFO - 'opt_config_files': (), 10:01:39 INFO - 'pip_index': False, 10:01:39 INFO - 'sps_profile': False, 10:01:39 INFO - 'sps_profile_interval': 0, 10:01:39 INFO - 'suite': 'dromaeojs-e10s', 10:01:39 INFO - 'system_bits': '32', 10:01:39 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 10:01:39 INFO - 'title': 'talos-linux64-ix-038', 10:01:39 INFO - 'tooltool_cache': '/builds/tooltool_cache', 10:01:39 INFO - 'use_talos_json': True, 10:01:39 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 10:01:39 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 10:01:39 INFO - 'work_dir': 'build'} 10:01:39 INFO - [mozharness: 2016-08-10 17:01:39.869087Z] Running clobber step. 10:01:39 INFO - Running pre-action listener: _resource_record_pre_action 10:01:39 INFO - Running main action method: clobber 10:01:39 INFO - rmtree: /builds/slave/test/build 10:01:39 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 10:01:40 INFO - Running post-action listener: _resource_record_post_action 10:01:40 INFO - [mozharness: 2016-08-10 17:01:40.858146Z] Finished clobber step (success) 10:01:40 INFO - [mozharness: 2016-08-10 17:01:40.858249Z] Running read-buildbot-config step. 10:01:40 INFO - Running pre-action listener: _resource_record_pre_action 10:01:40 INFO - Running main action method: read_buildbot_config 10:01:40 INFO - Using buildbot properties: 10:01:40 INFO - { 10:01:40 INFO - "project": "", 10:01:40 INFO - "product": "firefox", 10:01:40 INFO - "script_repo_revision": "production", 10:01:40 INFO - "builddir": "fx-team_ubuntu64_hw_test-dromaeojs-e10s", 10:01:40 INFO - "repository": "", 10:01:40 INFO - "buildername": "Ubuntu HW 12.04 x64 fx-team pgo talos dromaeojs-e10s", 10:01:40 INFO - "buildid": "20160810083014", 10:01:40 INFO - "pgo_build": "True", 10:01:40 INFO - "basedir": "/builds/slave/test", 10:01:40 INFO - "buildnumber": 663, 10:01:40 INFO - "slavename": "talos-linux64-ix-038", 10:01:40 INFO - "master": "http://buildbot-master104.bb.releng.scl3.mozilla.com:8201/", 10:01:40 INFO - "platform": "ubuntu64_hw", 10:01:40 INFO - "scheduler": "tests-fx-team-linux64-pgo-talos", 10:01:40 INFO - "branch": "fx-team", 10:01:40 INFO - "repo_path": "integration/fx-team", 10:01:40 INFO - "revision": "531100c1d950c8857dda172573fbd23360f7619b", 10:01:40 INFO - "stage_platform": "linux64-pgo", 10:01:40 INFO - "builduid": "7a24fc98c0f14960957fdefdcd3a16d9", 10:01:40 INFO - "slavebuilddir": "test" 10:01:40 INFO - } 10:01:40 INFO - Found installer url https://queue.taskcluster.net/v1/task/WONP0w2iSROXl5SW7huafg/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.tar.bz2. 10:01:40 INFO - Running post-action listener: _resource_record_post_action 10:01:40 INFO - [mozharness: 2016-08-10 17:01:40.860720Z] Finished read-buildbot-config step (success) 10:01:40 INFO - [mozharness: 2016-08-10 17:01:40.860810Z] Running download-and-extract step. 10:01:40 INFO - Running pre-action listener: _resource_record_pre_action 10:01:40 INFO - Running main action method: download_and_extract 10:01:40 INFO - mkdir: /builds/slave/test/build/tests 10:01:40 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 10:01:40 INFO - trying https://queue.taskcluster.net/v1/task/WONP0w2iSROXl5SW7huafg/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.test_packages.json 10:01:40 INFO - Downloading https://queue.taskcluster.net/v1/task/WONP0w2iSROXl5SW7huafg/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.test_packages.json to /builds/slave/test/build/firefox-51.0a1.en-US.linux-x86_64.test_packages.json 10:01:40 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/WONP0w2iSROXl5SW7huafg/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.test_packages.json', 'file_name': '/builds/slave/test/build/firefox-51.0a1.en-US.linux-x86_64.test_packages.json'}, attempt #1 10:01:41 INFO - Downloaded 1361 bytes. 10:01:41 INFO - Reading from file /builds/slave/test/build/firefox-51.0a1.en-US.linux-x86_64.test_packages.json 10:01:41 INFO - Using the following test package requirements: 10:01:41 INFO - {u'common': [u'firefox-51.0a1.en-US.linux-x86_64.common.tests.zip'], 10:01:41 INFO - u'cppunittest': [u'firefox-51.0a1.en-US.linux-x86_64.common.tests.zip', 10:01:41 INFO - u'firefox-51.0a1.en-US.linux-x86_64.cppunittest.tests.zip'], 10:01:41 INFO - u'gtest': [u'firefox-51.0a1.en-US.linux-x86_64.common.tests.zip', 10:01:41 INFO - u'firefox-51.0a1.en-US.linux-x86_64.gtest.tests.zip'], 10:01:41 INFO - u'jittest': [u'firefox-51.0a1.en-US.linux-x86_64.common.tests.zip', 10:01:41 INFO - u'jsshell-linux-x86_64.zip'], 10:01:41 INFO - u'mochitest': [u'firefox-51.0a1.en-US.linux-x86_64.common.tests.zip', 10:01:41 INFO - u'firefox-51.0a1.en-US.linux-x86_64.mochitest.tests.zip'], 10:01:41 INFO - u'mozbase': [u'firefox-51.0a1.en-US.linux-x86_64.common.tests.zip'], 10:01:41 INFO - u'reftest': [u'firefox-51.0a1.en-US.linux-x86_64.common.tests.zip', 10:01:41 INFO - u'firefox-51.0a1.en-US.linux-x86_64.reftest.tests.zip'], 10:01:41 INFO - u'talos': [u'firefox-51.0a1.en-US.linux-x86_64.common.tests.zip', 10:01:41 INFO - u'firefox-51.0a1.en-US.linux-x86_64.talos.tests.zip'], 10:01:41 INFO - u'web-platform': [u'firefox-51.0a1.en-US.linux-x86_64.common.tests.zip', 10:01:41 INFO - u'firefox-51.0a1.en-US.linux-x86_64.web-platform.tests.zip'], 10:01:41 INFO - u'xpcshell': [u'firefox-51.0a1.en-US.linux-x86_64.common.tests.zip', 10:01:41 INFO - u'firefox-51.0a1.en-US.linux-x86_64.xpcshell.tests.zip']} 10:01:41 INFO - Downloading packages: [u'firefox-51.0a1.en-US.linux-x86_64.common.tests.zip'] for test suite category: common 10:01:41 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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 10:01:41 INFO - trying https://queue.taskcluster.net/v1/task/WONP0w2iSROXl5SW7huafg/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.common.tests.zip 10:01:41 INFO - Downloading https://queue.taskcluster.net/v1/task/WONP0w2iSROXl5SW7huafg/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.common.tests.zip to /builds/slave/test/build/firefox-51.0a1.en-US.linux-x86_64.common.tests.zip 10:01:41 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/WONP0w2iSROXl5SW7huafg/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.common.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-51.0a1.en-US.linux-x86_64.common.tests.zip'}, attempt #1 10:01:42 INFO - Downloaded 21831360 bytes. 10:01:42 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-51.0a1.en-US.linux-x86_64.common.tests.zip', '-d', '/builds/slave/test/build/tests'] 10:01:42 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-51.0a1.en-US.linux-x86_64.common.tests.zip -d /builds/slave/test/build/tests 10:01:43 INFO - Return code: 0 10:01:43 INFO - Downloading packages: [u'firefox-51.0a1.en-US.linux-x86_64.common.tests.zip', u'firefox-51.0a1.en-US.linux-x86_64.talos.tests.zip'] for test suite category: talos 10:01:43 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 10:01:43 INFO - trying https://queue.taskcluster.net/v1/task/WONP0w2iSROXl5SW7huafg/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.common.tests.zip 10:01:43 INFO - Downloading https://queue.taskcluster.net/v1/task/WONP0w2iSROXl5SW7huafg/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.common.tests.zip to /builds/slave/test/build/firefox-51.0a1.en-US.linux-x86_64.common.tests.zip 10:01:43 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/WONP0w2iSROXl5SW7huafg/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.common.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-51.0a1.en-US.linux-x86_64.common.tests.zip'}, attempt #1 10:01:44 INFO - Downloaded 21831360 bytes. 10:01:44 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-51.0a1.en-US.linux-x86_64.common.tests.zip', '-d', '/builds/slave/test/build/tests'] 10:01:44 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-51.0a1.en-US.linux-x86_64.common.tests.zip -d /builds/slave/test/build/tests 10:01:45 INFO - Return code: 0 10:01: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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 10:01:45 INFO - trying https://queue.taskcluster.net/v1/task/WONP0w2iSROXl5SW7huafg/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.talos.tests.zip 10:01:45 INFO - Downloading https://queue.taskcluster.net/v1/task/WONP0w2iSROXl5SW7huafg/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.talos.tests.zip to /builds/slave/test/build/firefox-51.0a1.en-US.linux-x86_64.talos.tests.zip 10:01:45 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/WONP0w2iSROXl5SW7huafg/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.talos.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-51.0a1.en-US.linux-x86_64.talos.tests.zip'}, attempt #1 10:01:47 INFO - Downloaded 14413719 bytes. 10:01:47 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-51.0a1.en-US.linux-x86_64.talos.tests.zip', '-d', '/builds/slave/test/build/tests'] 10:01:47 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-51.0a1.en-US.linux-x86_64.talos.tests.zip -d /builds/slave/test/build/tests 10:01:47 INFO - Return code: 0 10:01:47 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 10:01:47 INFO - trying https://queue.taskcluster.net/v1/task/WONP0w2iSROXl5SW7huafg/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.tar.bz2 10:01:47 INFO - Downloading https://queue.taskcluster.net/v1/task/WONP0w2iSROXl5SW7huafg/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.tar.bz2 to /builds/slave/test/build/firefox-51.0a1.en-US.linux-x86_64.tar.bz2 10:01:47 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/WONP0w2iSROXl5SW7huafg/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.tar.bz2', 'file_name': '/builds/slave/test/build/firefox-51.0a1.en-US.linux-x86_64.tar.bz2'}, attempt #1 10:01:49 INFO - Downloaded 59371661 bytes. 10:01:49 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/WONP0w2iSROXl5SW7huafg/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.tar.bz2 10:01:49 INFO - mkdir: /builds/slave/test/properties 10:01:49 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 10:01:49 INFO - Writing to file /builds/slave/test/properties/build_url 10:01:49 INFO - Contents: 10:01:49 INFO - build_url:https://queue.taskcluster.net/v1/task/WONP0w2iSROXl5SW7huafg/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.tar.bz2 10:01:49 INFO - Running post-action listener: _resource_record_post_action 10:01:49 INFO - Running post-action listener: set_extra_try_arguments 10:01:49 INFO - [mozharness: 2016-08-10 17:01:49.694953Z] Finished download-and-extract step (success) 10:01:49 INFO - [mozharness: 2016-08-10 17:01:49.695187Z] Running populate-webroot step. 10:01:49 INFO - Running pre-action listener: _resource_record_pre_action 10:01:49 INFO - Running main action method: populate_webroot 10:01:49 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 10:01:49 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 10:01:49 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 10:01:49 INFO - '--tppagecycles', 10:01:49 INFO - '7'], 10:01:49 INFO - 'tests': ['tsvgm']}}, 10:01:49 INFO - 'suites': {'chromez': {'talos_options': ['--disable-e10s'], 10:01:49 INFO - 'tests': ['tresize', 'tcanvasmark']}, 10:01:49 INFO - 'chromez-e10s': {'tests': ['tresize', 'tcanvasmark']}, 10:01:49 INFO - 'dromaeojs': {'talos_options': ['--disable-e10s'], 10:01:49 INFO - 'tests': ['dromaeo_css', 'kraken']}, 10:01:49 INFO - 'dromaeojs-e10s': {'tests': ['dromaeo_css', 'kraken']}, 10:01:49 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 10:01:49 INFO - 'talos_options': ['--disable-e10s'], 10:01:49 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 10:01:49 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 10:01:49 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 10:01:49 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 10:01:49 INFO - 'talos_options': ['--disable-e10s'], 10:01:49 INFO - 'tests': ['damp', 'tps']}, 10:01:49 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 10:01:49 INFO - 'tests': ['damp', 'tps']}, 10:01:49 INFO - 'g3': {'talos_options': ['--disable-e10s'], 10:01:49 INFO - 'tests': ['dromaeo_dom']}, 10:01:49 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 10:01:49 INFO - 'g4': {'talos_options': ['--disable-e10s'], 10:01:49 INFO - 'tests': ['basic_compositor_video']}, 10:01:49 INFO - 'g4-e10s': {'tests': ['basic_compositor_video']}, 10:01:49 INFO - 'other': {'talos_options': ['--disable-e10s'], 10:01:49 INFO - 'tests': ['a11yr', 10:01:49 INFO - 'ts_paint', 10:01:49 INFO - 'tpaint', 10:01:49 INFO - 'sessionrestore', 10:01:49 INFO - 'sessionrestore_no_auto_restore', 10:01:49 INFO - 'tabpaint']}, 10:01:49 INFO - 'other-e10s': {'tests': ['a11yr', 10:01:49 INFO - 'ts_paint', 10:01:49 INFO - 'tpaint', 10:01:49 INFO - 'sessionrestore', 10:01:49 INFO - 'sessionrestore_no_auto_restore', 10:01:49 INFO - 'tabpaint']}, 10:01:49 INFO - 'other-e10s_l64': {'tests': ['a11yr', 10:01:49 INFO - 'ts_paint', 10:01:49 INFO - 'tpaint', 10:01:49 INFO - 'sessionrestore', 10:01:49 INFO - 'sessionrestore_no_auto_restore', 10:01:49 INFO - 'tabpaint']}, 10:01:49 INFO - 'other-e10s_nol64': {'tests': ['a11yr', 10:01:49 INFO - 'ts_paint', 10:01:49 INFO - 'tpaint', 10:01:49 INFO - 'sessionrestore', 10:01:49 INFO - 'sessionrestore_no_auto_restore', 10:01:49 INFO - 'tabpaint']}, 10:01:49 INFO - 'other_l64': {'talos_options': ['--disable-e10s'], 10:01:49 INFO - 'tests': ['a11yr', 10:01:49 INFO - 'ts_paint', 10:01:49 INFO - 'tpaint', 10:01:49 INFO - 'sessionrestore', 10:01:49 INFO - 'sessionrestore_no_auto_restore', 10:01:49 INFO - 'tabpaint']}, 10:01:49 INFO - 'other_nol64': {'talos_options': ['--disable-e10s'], 10:01:49 INFO - 'tests': ['a11yr', 10:01:49 INFO - 'ts_paint', 10:01:49 INFO - 'tpaint', 10:01:49 INFO - 'sessionrestore', 10:01:49 INFO - 'sessionrestore_no_auto_restore', 10:01:49 INFO - 'tabpaint']}, 10:01:49 INFO - 'svgr': {'talos_options': ['--disable-e10s'], 10:01:49 INFO - 'tests': ['tsvgx', 10:01:49 INFO - 'tsvgr_opacity', 10:01:49 INFO - 'tart', 10:01:49 INFO - 'tscrollx', 10:01:49 INFO - 'cart']}, 10:01:49 INFO - 'svgr-e10s': {'tests': ['tsvgx', 10:01:49 INFO - 'tsvgr_opacity', 10:01:49 INFO - 'tart', 10:01:49 INFO - 'tscrollx', 10:01:49 INFO - 'cart']}, 10:01:49 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 10:01:49 INFO - 'talos_options': ['--disable-e10s'], 10:01:49 INFO - 'tests': ['tp5o']}, 10:01:49 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 10:01:49 INFO - 'tests': ['tp5o']}, 10:01:49 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 10:01:49 INFO - 'talos_options': ['--disable-e10s', 10:01:49 INFO - '--xperf_path', 10:01:49 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 10:01:49 INFO - 'tests': ['tp5n']}, 10:01:49 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 10:01:49 INFO - 'talos_options': ['--xperf_path', 10:01:49 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 10:01:49 INFO - 'tests': ['tp5n']}}, 10:01:49 INFO - 'talos.zip': {'path': '', 10:01:49 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 10:01:49 INFO - Running post-action listener: _resource_record_post_action 10:01:49 INFO - [mozharness: 2016-08-10 17:01:49.716490Z] Finished populate-webroot step (success) 10:01:49 INFO - [mozharness: 2016-08-10 17:01:49.716580Z] Running create-virtualenv step. 10:01:49 INFO - Running pre-action listener: _resource_record_pre_action 10:01:49 INFO - Running main action method: create_virtualenv 10:01:49 INFO - Creating virtualenv /builds/slave/test/build/venv 10:01:49 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 10:01:49 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 10:01:49 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 10:01:49 INFO - Using real prefix '/usr' 10:01:49 INFO - New python executable in /builds/slave/test/build/venv/bin/python 10:01:50 INFO - Installing distribute.............................................................................................................................................................................................done. 10:01:52 INFO - Installing pip.................done. 10:01:52 INFO - Return code: 0 10:01:52 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 10:01:52 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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 10:01:52 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 10:01:52 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:01:52 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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 10:01:52 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 10:01:52 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:01:52 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 0x18fe030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1a618a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1bbf180>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1bbd3b0>, '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 0x1bbe2b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1bbe740>, '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': '8783db0840cc980e80bb0bd400000236-1470848496.927111-1403802561', '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 10:01:52 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 10:01:52 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 10:01:52 INFO - Using env: {'DISPLAY': ':0', 10:01:52 INFO - 'HOME': '/home/cltbld', 10:01:52 INFO - 'LANG': 'en_US.UTF-8', 10:01:52 INFO - 'LANGUAGE': 'en_US:en', 10:01:52 INFO - 'LOGNAME': 'cltbld', 10:01:52 INFO - 'MAIL': '/var/mail/cltbld', 10:01:52 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 10:01:52 INFO - 'MOZ_NO_REMOTE': '1', 10:01:52 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 10:01:52 INFO - 'NO_EM_RESTART': '1', 10:01:52 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 10:01:52 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 10:01:52 INFO - 'PWD': '/builds/slave/test', 10:01:52 INFO - 'SHELL': '/bin/bash', 10:01:52 INFO - 'SHLVL': '1', 10:01:52 INFO - 'TERM': 'linux', 10:01:52 INFO - 'TMOUT': '86400', 10:01:52 INFO - 'USER': 'cltbld', 10:01:52 INFO - 'XDG_SESSION_COOKIE': '8783db0840cc980e80bb0bd400000236-1470848496.927111-1403802561', 10:01:52 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 10:01:52 INFO - '_': '/tools/buildbot/bin/python'} 10:01:52 INFO - Ignoring indexes: https://pypi.python.org/simple/ 10:01:52 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 10:01:52 INFO - Cleaning up... 10:01:52 INFO - Return code: 0 10:01:52 INFO - Installing psutil>=3.1.1 into virtualenv /builds/slave/test/build/venv 10:01:52 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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 10:01:52 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 10:01:52 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:01:52 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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 10:01:52 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 10:01:52 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:01:52 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 0x18fe030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1a618a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1bbf180>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1bbd3b0>, '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 0x1bbe2b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1bbe740>, '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': '8783db0840cc980e80bb0bd400000236-1470848496.927111-1403802561', '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 10:01:52 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 10:01:52 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 10:01:52 INFO - Using env: {'DISPLAY': ':0', 10:01:52 INFO - 'HOME': '/home/cltbld', 10:01:52 INFO - 'LANG': 'en_US.UTF-8', 10:01:52 INFO - 'LANGUAGE': 'en_US:en', 10:01:52 INFO - 'LOGNAME': 'cltbld', 10:01:52 INFO - 'MAIL': '/var/mail/cltbld', 10:01:52 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 10:01:52 INFO - 'MOZ_NO_REMOTE': '1', 10:01:52 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 10:01:52 INFO - 'NO_EM_RESTART': '1', 10:01:52 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 10:01:52 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 10:01:52 INFO - 'PWD': '/builds/slave/test', 10:01:52 INFO - 'SHELL': '/bin/bash', 10:01:52 INFO - 'SHLVL': '1', 10:01:52 INFO - 'TERM': 'linux', 10:01:52 INFO - 'TMOUT': '86400', 10:01:52 INFO - 'USER': 'cltbld', 10:01:52 INFO - 'XDG_SESSION_COOKIE': '8783db0840cc980e80bb0bd400000236-1470848496.927111-1403802561', 10:01:52 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 10:01:52 INFO - '_': '/tools/buildbot/bin/python'} 10:01:52 INFO - Ignoring indexes: https://pypi.python.org/simple/ 10:01:52 INFO - Downloading/unpacking psutil>=3.1.1 10:01:52 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 10:01:52 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 10:01:52 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 10:01:52 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 10:01:52 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 10:01:52 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 10:01:54 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 10:01:54 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 10:01:54 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 10:01:54 INFO - Installing collected packages: psutil 10:01:54 INFO - Running setup.py install for psutil 10:01:54 INFO - building 'psutil._psutil_linux' extension 10:01:54 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 10:01:54 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 10:01:54 INFO - building 'psutil._psutil_posix' extension 10:01:54 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 10:01:55 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 10:01:55 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 10:01:55 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 10:01:55 INFO - Successfully installed psutil 10:01:55 INFO - Cleaning up... 10:01:55 INFO - Return code: 0 10:01:55 INFO - Installing mozsystemmonitor==0.3 into virtualenv /builds/slave/test/build/venv 10:01:55 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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 10:01:55 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 10:01:55 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:01:55 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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 10:01:55 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 10:01:55 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:01:55 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 0x18fe030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1a618a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1bbf180>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1bbd3b0>, '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 0x1bbe2b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1bbe740>, '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': '8783db0840cc980e80bb0bd400000236-1470848496.927111-1403802561', '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 10:01:55 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 10:01:55 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 10:01:55 INFO - Using env: {'DISPLAY': ':0', 10:01:55 INFO - 'HOME': '/home/cltbld', 10:01:55 INFO - 'LANG': 'en_US.UTF-8', 10:01:55 INFO - 'LANGUAGE': 'en_US:en', 10:01:55 INFO - 'LOGNAME': 'cltbld', 10:01:55 INFO - 'MAIL': '/var/mail/cltbld', 10:01:55 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 10:01:55 INFO - 'MOZ_NO_REMOTE': '1', 10:01:55 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 10:01:55 INFO - 'NO_EM_RESTART': '1', 10:01:55 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 10:01:55 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 10:01:55 INFO - 'PWD': '/builds/slave/test', 10:01:55 INFO - 'SHELL': '/bin/bash', 10:01:55 INFO - 'SHLVL': '1', 10:01:55 INFO - 'TERM': 'linux', 10:01:55 INFO - 'TMOUT': '86400', 10:01:55 INFO - 'USER': 'cltbld', 10:01:55 INFO - 'XDG_SESSION_COOKIE': '8783db0840cc980e80bb0bd400000236-1470848496.927111-1403802561', 10:01:55 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 10:01:55 INFO - '_': '/tools/buildbot/bin/python'} 10:01:55 INFO - Ignoring indexes: https://pypi.python.org/simple/ 10:01:55 INFO - Downloading/unpacking mozsystemmonitor==0.3 10:01:55 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 10:01:55 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 10:01:55 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 10:01:55 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 10:01:55 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 10:01:55 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 10:01:57 INFO - Downloading mozsystemmonitor-0.3.tar.gz 10:01:57 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 10:01:57 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.3) 10:01:57 INFO - Installing collected packages: mozsystemmonitor 10:01:57 INFO - Running setup.py install for mozsystemmonitor 10:01:57 INFO - Successfully installed mozsystemmonitor 10:01:57 INFO - Cleaning up... 10:01:57 INFO - Return code: 0 10:01:57 INFO - Installing jsonschema==2.5.1 into virtualenv /builds/slave/test/build/venv 10:01: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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 10:01:57 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 10:01:57 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:01: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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 10:01:57 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 10:01:57 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:01:57 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 0x18fe030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1a618a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1bbf180>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1bbd3b0>, '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 0x1bbe2b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1bbe740>, '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': '8783db0840cc980e80bb0bd400000236-1470848496.927111-1403802561', '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 10:01:57 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 10:01:57 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 10:01:57 INFO - Using env: {'DISPLAY': ':0', 10:01:57 INFO - 'HOME': '/home/cltbld', 10:01:57 INFO - 'LANG': 'en_US.UTF-8', 10:01:57 INFO - 'LANGUAGE': 'en_US:en', 10:01:57 INFO - 'LOGNAME': 'cltbld', 10:01:57 INFO - 'MAIL': '/var/mail/cltbld', 10:01:57 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 10:01:57 INFO - 'MOZ_NO_REMOTE': '1', 10:01:57 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 10:01:57 INFO - 'NO_EM_RESTART': '1', 10:01:57 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 10:01:57 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 10:01:57 INFO - 'PWD': '/builds/slave/test', 10:01:57 INFO - 'SHELL': '/bin/bash', 10:01:57 INFO - 'SHLVL': '1', 10:01:57 INFO - 'TERM': 'linux', 10:01:57 INFO - 'TMOUT': '86400', 10:01:57 INFO - 'USER': 'cltbld', 10:01:57 INFO - 'XDG_SESSION_COOKIE': '8783db0840cc980e80bb0bd400000236-1470848496.927111-1403802561', 10:01:57 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 10:01:57 INFO - '_': '/tools/buildbot/bin/python'} 10:01:57 INFO - Ignoring indexes: https://pypi.python.org/simple/ 10:01:57 INFO - Downloading/unpacking jsonschema==2.5.1 10:01:57 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 10:01:57 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 10:01:57 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 10:01:57 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 10:01:57 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 10:01:57 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 10:01:59 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 10:01:59 INFO - Downloading/unpacking functools32 (from jsonschema==2.5.1) 10:01:59 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 10:01:59 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 10:01:59 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 10:01:59 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 10:01:59 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 10:01:59 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 10:01:59 INFO - Downloading functools32-3.2.3-2.tar.gz 10:01:59 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/functools32/setup.py) egg_info for package functools32 10:01:59 INFO - warning: no files found matching '*.txt' 10:01:59 INFO - no previously-included directories found matching 'build' 10:01:59 INFO - no previously-included directories found matching 'dist' 10:01:59 INFO - no previously-included directories found matching '.git*' 10:01:59 INFO - Installing collected packages: jsonschema, functools32 10:01:59 INFO - Running setup.py install for functools32 10:02:00 INFO - warning: no files found matching '*.txt' 10:02:00 INFO - no previously-included directories found matching 'build' 10:02:00 INFO - no previously-included directories found matching 'dist' 10:02:00 INFO - no previously-included directories found matching '.git*' 10:02:00 INFO - Successfully installed jsonschema functools32 10:02:00 INFO - Cleaning up... 10:02:00 INFO - Return code: 0 10:02:00 INFO - Installing functools32==3.2.3-2 into virtualenv /builds/slave/test/build/venv 10:02: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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 10:02:00 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 10:02:00 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:02: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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 10:02:00 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 10:02:00 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:02:00 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', 'functools32==3.2.3-2']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x18fe030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1a618a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1bbf180>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1bbd3b0>, '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 0x1bbe2b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1bbe740>, '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': '8783db0840cc980e80bb0bd400000236-1470848496.927111-1403802561', '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 10:02:00 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', 'functools32==3.2.3-2'] in /builds/slave/test/build 10:02:00 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 functools32==3.2.3-2 10:02:00 INFO - Using env: {'DISPLAY': ':0', 10:02:00 INFO - 'HOME': '/home/cltbld', 10:02:00 INFO - 'LANG': 'en_US.UTF-8', 10:02:00 INFO - 'LANGUAGE': 'en_US:en', 10:02:00 INFO - 'LOGNAME': 'cltbld', 10:02:00 INFO - 'MAIL': '/var/mail/cltbld', 10:02:00 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 10:02:00 INFO - 'MOZ_NO_REMOTE': '1', 10:02:00 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 10:02:00 INFO - 'NO_EM_RESTART': '1', 10:02:00 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 10:02:00 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 10:02:00 INFO - 'PWD': '/builds/slave/test', 10:02:00 INFO - 'SHELL': '/bin/bash', 10:02:00 INFO - 'SHLVL': '1', 10:02:00 INFO - 'TERM': 'linux', 10:02:00 INFO - 'TMOUT': '86400', 10:02:00 INFO - 'USER': 'cltbld', 10:02:00 INFO - 'XDG_SESSION_COOKIE': '8783db0840cc980e80bb0bd400000236-1470848496.927111-1403802561', 10:02:00 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 10:02:00 INFO - '_': '/tools/buildbot/bin/python'} 10:02:00 INFO - Ignoring indexes: https://pypi.python.org/simple/ 10:02:00 INFO - Requirement already satisfied (use --upgrade to upgrade): functools32==3.2.3-2 in ./venv/lib/python2.7/site-packages 10:02:00 INFO - Cleaning up... 10:02:00 INFO - Return code: 0 10:02:00 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 10:02: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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 10:02:00 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 10:02:00 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:02: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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 10:02:00 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 10:02:00 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:02:00 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 0x18fe030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1a618a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1bbf180>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1bbd3b0>, '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 0x1bbe2b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1bbe740>, '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': '8783db0840cc980e80bb0bd400000236-1470848496.927111-1403802561', '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 10:02:00 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 10:02:00 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 10:02:00 INFO - Using env: {'DISPLAY': ':0', 10:02:00 INFO - 'HOME': '/home/cltbld', 10:02:00 INFO - 'LANG': 'en_US.UTF-8', 10:02:00 INFO - 'LANGUAGE': 'en_US:en', 10:02:00 INFO - 'LOGNAME': 'cltbld', 10:02:00 INFO - 'MAIL': '/var/mail/cltbld', 10:02:00 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 10:02:00 INFO - 'MOZ_NO_REMOTE': '1', 10:02:00 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 10:02:00 INFO - 'NO_EM_RESTART': '1', 10:02:00 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 10:02:00 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 10:02:00 INFO - 'PWD': '/builds/slave/test', 10:02:00 INFO - 'SHELL': '/bin/bash', 10:02:00 INFO - 'SHLVL': '1', 10:02:00 INFO - 'TERM': 'linux', 10:02:00 INFO - 'TMOUT': '86400', 10:02:00 INFO - 'USER': 'cltbld', 10:02:00 INFO - 'XDG_SESSION_COOKIE': '8783db0840cc980e80bb0bd400000236-1470848496.927111-1403802561', 10:02:00 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 10:02:00 INFO - '_': '/tools/buildbot/bin/python'} 10:02:00 INFO - Ignoring indexes: https://pypi.python.org/simple/ 10:02:00 INFO - Downloading/unpacking blobuploader==1.2.4 10:02:00 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 10:02:00 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 10:02:00 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 10:02:00 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 10:02:00 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 10:02:00 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 10:02:02 INFO - Downloading blobuploader-1.2.4.tar.gz 10:02:02 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 10:02:02 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 10:02:02 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 10:02:02 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 10:02:02 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 10:02:02 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 10:02:02 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 10:02:02 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 10:02:02 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 10:02:02 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 10:02:02 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 10:02:02 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 10:02:02 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 10:02:02 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 10:02:02 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 10:02:02 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 10:02:03 INFO - Downloading docopt-0.6.1.tar.gz 10:02:03 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 10:02:03 INFO - Installing collected packages: blobuploader, requests, docopt 10:02:03 INFO - Running setup.py install for blobuploader 10:02:03 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 10:02:03 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 10:02:03 INFO - Running setup.py install for requests 10:02:03 INFO - Running setup.py install for docopt 10:02:03 INFO - Successfully installed blobuploader requests docopt 10:02:03 INFO - Cleaning up... 10:02:03 INFO - Return code: 0 10:02:03 INFO - Installing None into virtualenv /builds/slave/test/build/venv 10:02: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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 10:02:03 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 10:02:03 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:02: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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 10:02:03 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 10:02:03 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:02:03 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 0x18fe030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1a618a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1bbf180>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1bbd3b0>, '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 0x1bbe2b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1bbe740>, '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': '8783db0840cc980e80bb0bd400000236-1470848496.927111-1403802561', '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 10:02:03 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 10:02:03 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 10:02:03 INFO - Using env: {'DISPLAY': ':0', 10:02:03 INFO - 'HOME': '/home/cltbld', 10:02:03 INFO - 'LANG': 'en_US.UTF-8', 10:02:03 INFO - 'LANGUAGE': 'en_US:en', 10:02:03 INFO - 'LOGNAME': 'cltbld', 10:02:03 INFO - 'MAIL': '/var/mail/cltbld', 10:02:03 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 10:02:03 INFO - 'MOZ_NO_REMOTE': '1', 10:02:03 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 10:02:03 INFO - 'NO_EM_RESTART': '1', 10:02:03 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 10:02:03 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 10:02:03 INFO - 'PWD': '/builds/slave/test', 10:02:03 INFO - 'SHELL': '/bin/bash', 10:02:03 INFO - 'SHLVL': '1', 10:02:03 INFO - 'TERM': 'linux', 10:02:03 INFO - 'TMOUT': '86400', 10:02:03 INFO - 'USER': 'cltbld', 10:02:03 INFO - 'XDG_SESSION_COOKIE': '8783db0840cc980e80bb0bd400000236-1470848496.927111-1403802561', 10:02:03 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 10:02:03 INFO - '_': '/tools/buildbot/bin/python'} 10:02:04 INFO - Ignoring indexes: https://pypi.python.org/simple/ 10:02:04 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 10:02:04 INFO - Running setup.py (path:/tmp/pip-LzQs43-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 10:02:04 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 10:02:04 INFO - Running setup.py (path:/tmp/pip-4xAMZu-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 10:02:04 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 10:02:04 INFO - Running setup.py (path:/tmp/pip-Yp1sJi-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 10:02:04 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 10:02:04 INFO - Running setup.py (path:/tmp/pip-W1rFJL-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 10:02:04 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 10:02:04 INFO - Running setup.py (path:/tmp/pip-5HisiJ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 10:02:04 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 10:02:04 INFO - Running setup.py (path:/tmp/pip-Ksufct-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 10:02:04 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 10:02:04 INFO - Running setup.py (path:/tmp/pip-IEzjns-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 10:02:04 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 10:02:04 INFO - Running setup.py (path:/tmp/pip-IYAhPx-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 10:02:04 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 10:02:04 INFO - Running setup.py (path:/tmp/pip-6QCstp-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 10:02:04 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 10:02:04 INFO - Running setup.py (path:/tmp/pip-6qLk0Z-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 10:02:04 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 10:02:04 INFO - Running setup.py (path:/tmp/pip-KNbnzH-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 10:02:04 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 10:02:04 INFO - Running setup.py (path:/tmp/pip-Qzfdxw-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 10:02:04 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 10:02:04 INFO - Running setup.py (path:/tmp/pip-kpMExD-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 10:02:04 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 10:02:04 INFO - Running setup.py (path:/tmp/pip-zvSQAM-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 10:02:05 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 10:02:05 INFO - Running setup.py (path:/tmp/pip-YVOoZX-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 10:02:05 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 10:02:05 INFO - Running setup.py (path:/tmp/pip-E9_ijZ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 10:02:05 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 10:02:05 INFO - Running setup.py (path:/tmp/pip-qhxgEE-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 10:02:05 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 10:02:05 INFO - Running setup.py install for manifestparser 10:02:05 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 10:02:05 INFO - Running setup.py install for mozcrash 10:02:05 INFO - Running setup.py install for mozdebug 10:02:05 INFO - Running setup.py install for mozdevice 10:02:05 INFO - Installing sutini script to /builds/slave/test/build/venv/bin 10:02:05 INFO - Installing dm script to /builds/slave/test/build/venv/bin 10:02:05 INFO - Running setup.py install for mozfile 10:02:05 INFO - Running setup.py install for mozhttpd 10:02:05 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 10:02:05 INFO - Running setup.py install for mozinfo 10:02:05 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 10:02:05 INFO - Running setup.py install for mozInstall 10:02:06 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 10:02:06 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 10:02:06 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 10:02:06 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 10:02:06 INFO - Running setup.py install for mozleak 10:02:06 INFO - Running setup.py install for mozlog 10:02:06 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 10:02:06 INFO - Running setup.py install for moznetwork 10:02:06 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 10:02:06 INFO - Running setup.py install for mozprocess 10:02:06 INFO - Running setup.py install for mozprofile 10:02:06 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 10:02:06 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 10:02:06 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 10:02:06 INFO - Running setup.py install for mozrunner 10:02:06 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 10:02:06 INFO - Running setup.py install for mozscreenshot 10:02:06 INFO - Running setup.py install for moztest 10:02:06 INFO - Running setup.py install for mozversion 10:02:07 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 10:02:07 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 10:02:07 INFO - Cleaning up... 10:02:07 INFO - Return code: 0 10:02:07 INFO - Installing None into virtualenv /builds/slave/test/build/venv 10:02:07 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 10:02:07 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 10:02:07 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:02:07 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 10:02:07 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 10:02:07 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:02:07 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 0x18fe030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1a618a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1bbf180>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1bbd3b0>, '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 0x1bbe2b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1bbe740>, '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': '8783db0840cc980e80bb0bd400000236-1470848496.927111-1403802561', '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 10:02:07 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 10:02:07 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 10:02:07 INFO - Using env: {'DISPLAY': ':0', 10:02:07 INFO - 'HOME': '/home/cltbld', 10:02:07 INFO - 'LANG': 'en_US.UTF-8', 10:02:07 INFO - 'LANGUAGE': 'en_US:en', 10:02:07 INFO - 'LOGNAME': 'cltbld', 10:02:07 INFO - 'MAIL': '/var/mail/cltbld', 10:02:07 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 10:02:07 INFO - 'MOZ_NO_REMOTE': '1', 10:02:07 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 10:02:07 INFO - 'NO_EM_RESTART': '1', 10:02:07 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 10:02:07 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 10:02:07 INFO - 'PWD': '/builds/slave/test', 10:02:07 INFO - 'SHELL': '/bin/bash', 10:02:07 INFO - 'SHLVL': '1', 10:02:07 INFO - 'TERM': 'linux', 10:02:07 INFO - 'TMOUT': '86400', 10:02:07 INFO - 'USER': 'cltbld', 10:02:07 INFO - 'XDG_SESSION_COOKIE': '8783db0840cc980e80bb0bd400000236-1470848496.927111-1403802561', 10:02:07 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 10:02:07 INFO - '_': '/tools/buildbot/bin/python'} 10:02:07 INFO - Ignoring indexes: https://pypi.python.org/simple/ 10:02:07 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 10:02:07 INFO - Running setup.py (path:/tmp/pip-Kgv7Cs-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 10:02:07 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)) 10:02:07 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 10:02:07 INFO - Running setup.py (path:/tmp/pip-KVz_1m-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 10:02:07 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)) 10:02:07 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 10:02:07 INFO - Running setup.py (path:/tmp/pip-zrT5AX-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 10:02:07 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)) 10:02:07 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 10:02:07 INFO - Running setup.py (path:/tmp/pip-dbWlLd-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 10:02:07 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)) 10:02:07 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 10:02:07 INFO - Running setup.py (path:/tmp/pip-xPRJC0-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 10:02:07 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)) 10:02:07 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 10:02:07 INFO - Running setup.py (path:/tmp/pip-QQo7EO-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 10:02:07 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)) 10:02:07 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 10:02:07 INFO - Running setup.py (path:/tmp/pip-yYXLjs-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 10:02:07 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)) 10:02:07 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 10:02:07 INFO - Running setup.py (path:/tmp/pip-XqfAcn-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 10:02:07 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)) 10:02:07 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 10:02:07 INFO - Running setup.py (path:/tmp/pip-hgS4yr-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 10:02:07 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)) 10:02:07 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 10:02:07 INFO - Running setup.py (path:/tmp/pip-CcqJu7-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 10:02:07 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog==3.3 from file:///builds/slave/test/build/tests/mozbase/mozlog in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 10:02:07 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 10:02:07 INFO - Running setup.py (path:/tmp/pip-G1caFf-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 10:02:08 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)) 10:02:08 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 10:02:08 INFO - Running setup.py (path:/tmp/pip-QVtrOk-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 10:02:08 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)) 10:02:08 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 10:02:08 INFO - Running setup.py (path:/tmp/pip-v8LG6Y-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 10:02:08 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)) 10:02:08 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 10:02:08 INFO - Running setup.py (path:/tmp/pip-MgbDzG-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 10:02:08 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)) 10:02:08 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 10:02:08 INFO - Running setup.py (path:/tmp/pip-4Jo1lY-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 10:02:08 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)) 10:02:08 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 10:02:08 INFO - Running setup.py (path:/tmp/pip-C9TeFW-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 10:02:08 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)) 10:02:08 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 10:02:08 INFO - Running setup.py (path:/tmp/pip-5G8Qlg-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 10:02:08 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)) 10:02:08 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)) 10:02:08 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)) 10:02:08 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)) 10:02:08 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)) 10:02:08 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)) 10:02:08 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.3->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 10:02:08 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 10:02:08 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 10:02:08 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 10:02:08 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 10:02:08 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 10:02:08 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 10:02:10 INFO - Downloading blessings-1.6.tar.gz 10:02:10 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 10:02:10 INFO - Installing collected packages: blessings 10:02:10 INFO - Running setup.py install for blessings 10:02:10 INFO - Successfully installed blessings 10:02:10 INFO - Cleaning up... 10:02:10 INFO - Return code: 0 10:02:10 INFO - Done creating virtualenv /builds/slave/test/build/venv. 10:02:10 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 10:02:10 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 10:02:10 INFO - Reading from file tmpfile_stdout 10:02:10 INFO - Current package versions: 10:02:10 INFO - argparse == 1.2.1 10:02:10 INFO - blessings == 1.6 10:02:10 INFO - blobuploader == 1.2.4 10:02:10 INFO - docopt == 0.6.1 10:02:10 INFO - functools32 == 3.2.3-2 10:02:10 INFO - jsonschema == 2.5.1 10:02:10 INFO - manifestparser == 1.1 10:02:10 INFO - mozInstall == 1.12 10:02:10 INFO - mozcrash == 0.17 10:02:10 INFO - mozdebug == 0.1 10:02:10 INFO - mozdevice == 0.48 10:02:10 INFO - mozfile == 1.2 10:02:10 INFO - mozhttpd == 0.7 10:02:10 INFO - mozinfo == 0.9 10:02:10 INFO - mozleak == 0.1 10:02:10 INFO - mozlog == 3.3 10:02:10 INFO - moznetwork == 0.27 10:02:10 INFO - mozprocess == 0.23 10:02:10 INFO - mozprofile == 0.28 10:02:10 INFO - mozrunner == 6.12 10:02:10 INFO - mozscreenshot == 0.1 10:02:10 INFO - mozsystemmonitor == 0.3 10:02:10 INFO - moztest == 0.7 10:02:10 INFO - mozversion == 1.4 10:02:10 INFO - psutil == 3.1.1 10:02:10 INFO - requests == 1.2.3 10:02:10 INFO - wsgiref == 0.1.2 10:02:10 INFO - Installing None into virtualenv /builds/slave/test/build/venv 10:02:10 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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 10:02:10 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 10:02:10 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:02:10 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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 10:02:10 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 10:02:10 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:02:10 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 0x18fe030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1a618a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1bbf180>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1bbd3b0>, '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 0x1bbe2b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1bbe740>, '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': '8783db0840cc980e80bb0bd400000236-1470848496.927111-1403802561', '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 10:02:10 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 10:02:10 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 10:02:10 INFO - Using env: {'DISPLAY': ':0', 10:02:10 INFO - 'HOME': '/home/cltbld', 10:02:10 INFO - 'LANG': 'en_US.UTF-8', 10:02:10 INFO - 'LANGUAGE': 'en_US:en', 10:02:10 INFO - 'LOGNAME': 'cltbld', 10:02:10 INFO - 'MAIL': '/var/mail/cltbld', 10:02:10 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 10:02:10 INFO - 'MOZ_NO_REMOTE': '1', 10:02:10 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 10:02:10 INFO - 'NO_EM_RESTART': '1', 10:02:10 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 10:02:10 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 10:02:10 INFO - 'PWD': '/builds/slave/test', 10:02:10 INFO - 'SHELL': '/bin/bash', 10:02:10 INFO - 'SHLVL': '1', 10:02:10 INFO - 'TERM': 'linux', 10:02:10 INFO - 'TMOUT': '86400', 10:02:10 INFO - 'USER': 'cltbld', 10:02:10 INFO - 'XDG_SESSION_COOKIE': '8783db0840cc980e80bb0bd400000236-1470848496.927111-1403802561', 10:02:10 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 10:02:10 INFO - '_': '/tools/buildbot/bin/python'} 10:02:11 INFO - Ignoring indexes: https://pypi.python.org/simple/ 10:02:11 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)) 10:02:11 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)) 10:02:11 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)) 10:02:11 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)) 10:02:11 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)) 10:02:11 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)) 10:02:11 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)) 10:02:11 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)) 10:02:11 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)) 10:02:11 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)) 10:02:11 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)) 10:02:11 INFO - Cleaning up... 10:02:11 INFO - Return code: 0 10:02:11 INFO - Installing jsonschema into virtualenv /builds/slave/test/build/venv 10:02:11 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 10:02:11 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 10:02:11 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:02:11 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 10:02:11 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 10:02:11 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:02:11 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 0x18fe030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1a618a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1bbf180>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1bbd3b0>, '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 0x1bbe2b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1bbe740>, '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': '8783db0840cc980e80bb0bd400000236-1470848496.927111-1403802561', '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 10:02:11 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 10:02:11 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 10:02:11 INFO - Using env: {'DISPLAY': ':0', 10:02:11 INFO - 'HOME': '/home/cltbld', 10:02:11 INFO - 'LANG': 'en_US.UTF-8', 10:02:11 INFO - 'LANGUAGE': 'en_US:en', 10:02:11 INFO - 'LOGNAME': 'cltbld', 10:02:11 INFO - 'MAIL': '/var/mail/cltbld', 10:02:11 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 10:02:11 INFO - 'MOZ_NO_REMOTE': '1', 10:02:11 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 10:02:11 INFO - 'NO_EM_RESTART': '1', 10:02:11 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 10:02:11 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 10:02:11 INFO - 'PWD': '/builds/slave/test', 10:02:11 INFO - 'SHELL': '/bin/bash', 10:02:11 INFO - 'SHLVL': '1', 10:02:11 INFO - 'TERM': 'linux', 10:02:11 INFO - 'TMOUT': '86400', 10:02:11 INFO - 'USER': 'cltbld', 10:02:11 INFO - 'XDG_SESSION_COOKIE': '8783db0840cc980e80bb0bd400000236-1470848496.927111-1403802561', 10:02:11 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 10:02:11 INFO - '_': '/tools/buildbot/bin/python'} 10:02:11 INFO - Ignoring indexes: https://pypi.python.org/simple/ 10:02:11 INFO - Requirement already satisfied (use --upgrade to upgrade): jsonschema in ./venv/lib/python2.7/site-packages 10:02:11 INFO - Cleaning up... 10:02:11 INFO - Return code: 0 10:02:11 INFO - Running post-action listener: _resource_record_post_action 10:02:11 INFO - Running post-action listener: _start_resource_monitoring 10:02:11 INFO - Starting resource monitoring. 10:02:11 INFO - [mozharness: 2016-08-10 17:02:11.337155Z] Finished create-virtualenv step (success) 10:02:11 INFO - [mozharness: 2016-08-10 17:02:11.337596Z] Running install step. 10:02:11 INFO - Running pre-action listener: _resource_record_pre_action 10:02:11 INFO - Running main action method: install 10:02:11 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 10:02:11 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 10:02:11 INFO - Reading from file tmpfile_stdout 10:02:11 INFO - Detecting whether we're running mozinstall >=1.0... 10:02:11 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 10:02:11 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 10:02:11 INFO - Reading from file tmpfile_stdout 10:02:11 INFO - Output received: 10:02:11 INFO - Usage: mozinstall [options] installer 10:02:11 INFO - Options: 10:02:11 INFO - -h, --help show this help message and exit 10:02:11 INFO - -d DEST, --destination=DEST 10:02:11 INFO - Directory to install application into. [default: 10:02:11 INFO - "/builds/slave/test"] 10:02:11 INFO - --app=APP Application being installed. [default: firefox] 10:02:11 INFO - mkdir: /builds/slave/test/build/application 10:02:11 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '/builds/slave/test/build/firefox-51.0a1.en-US.linux-x86_64.tar.bz2', '--destination', '/builds/slave/test/build/application'] 10:02:11 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall /builds/slave/test/build/firefox-51.0a1.en-US.linux-x86_64.tar.bz2 --destination /builds/slave/test/build/application 10:02:28 INFO - Reading from file tmpfile_stdout 10:02:28 INFO - Output received: 10:02:28 INFO - /builds/slave/test/build/application/firefox/firefox 10:02:28 INFO - Running post-action listener: _resource_record_post_action 10:02:28 INFO - [mozharness: 2016-08-10 17:02:28.534294Z] Finished install step (success) 10:02:28 INFO - [mozharness: 2016-08-10 17:02:28.534542Z] Running run-tests step. 10:02:28 INFO - Running pre-action listener: _resource_record_pre_action 10:02:28 INFO - Running main action method: run_tests 10:02:28 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 10:02:28 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 10:02:28 INFO - Python 2.7.3 10:02:28 INFO - Return code: 0 10:02:28 INFO - grabbing minidump binary from tooltool 10:02: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://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 10:02:28 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 0x1bbd3b0>, '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 0x1bbe2b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1bbe740>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 10:02:28 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 10:02:28 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 10:02:28 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 10:02:28 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 10:02:28 INFO - Return code: 0 10:02:28 INFO - Chmoding /builds/slave/test/build/linux64-minidump_stackwalk to 0755 10:02:28 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 10:02:28 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 10:02:28 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/linux64-minidump_stackwalk 10:02:28 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 10:02:28 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Fx-Team', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/WONP0w2iSROXl5SW7huafg/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-038', '--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 10:02:28 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/tests/talos/talos/run_tests.py --branchName Fx-Team --suite dromaeojs-e10s --executablePath /builds/slave/test/build/application/firefox/firefox --symbolsPath https://queue.taskcluster.net/v1/task/WONP0w2iSROXl5SW7huafg/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.crashreporter-symbols.zip --title talos-linux64-ix-038 --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 10:02:28 INFO - Using env: {'DISPLAY': ':0', 10:02:28 INFO - 'HOME': '/home/cltbld', 10:02:28 INFO - 'LANG': 'en_US.UTF-8', 10:02:28 INFO - 'LANGUAGE': 'en_US:en', 10:02:28 INFO - 'LOGNAME': 'cltbld', 10:02:28 INFO - 'MAIL': '/var/mail/cltbld', 10:02:28 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 10:02:28 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/linux64-minidump_stackwalk', 10:02:28 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 10:02:28 INFO - 'MOZ_NO_REMOTE': '1', 10:02:28 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 10:02:28 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 10:02:28 INFO - 'NO_EM_RESTART': '1', 10:02:28 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 10:02:28 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 10:02:28 INFO - 'PWD': '/builds/slave/test', 10:02:28 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 10:02:28 INFO - 'SHELL': '/bin/bash', 10:02:28 INFO - 'SHLVL': '1', 10:02:28 INFO - 'TERM': 'linux', 10:02:28 INFO - 'TMOUT': '86400', 10:02:28 INFO - 'USER': 'cltbld', 10:02:28 INFO - 'XDG_SESSION_COOKIE': '8783db0840cc980e80bb0bd400000236-1470848496.927111-1403802561', 10:02:28 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 10:02:28 INFO - '_': '/tools/buildbot/bin/python'} 10:02:28 INFO - Calling ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Fx-Team', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/WONP0w2iSROXl5SW7huafg/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-038', '--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 10:02:28 INFO - mozversion application_buildid: 20160810083014 10:02:28 INFO - mozversion application_changeset: 531100c1d950c8857dda172573fbd23360f7619b 10:02:28 INFO - mozversion application_display_name: Nightly 10:02:28 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 10:02:28 INFO - mozversion application_name: Firefox 10:02:28 INFO - mozversion application_remotingname: firefox 10:02:28 INFO - mozversion application_repository: https://hg.mozilla.org/integration/fx-team 10:02:28 INFO - mozversion application_vendor: Mozilla 10:02:28 INFO - mozversion application_version: 51.0a1 10:02:28 INFO - mozversion platform_buildid: 20160810083014 10:02:28 INFO - mozversion platform_changeset: 531100c1d950c8857dda172573fbd23360f7619b 10:02:28 INFO - mozversion platform_repository: https://hg.mozilla.org/integration/fx-team 10:02:28 INFO - mozversion platform_version: 51.0a1 10:02:28 INFO - using testdate: 1470848548 10:02:28 INFO - actual date: 1470848548 10:02:28 INFO - starting webserver on 'localhost:33760' 10:02:28 INFO - SUITE-START | Running 2 tests 10:02:28 INFO - TEST-START | dromaeo_css 10:02:28 INFO - operating with platform_type : linux_ 10:02:28 INFO - Initialising browser for dromaeo_css test... 10:02:28 INFO - TEST-INFO | started process 20723 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmp3Rr67l/profile http://localhost:33760/getInfo.html) 10:02:33 INFO - PROCESS | 20723 | __metrics Screen width/height:1600/1200 10:02:33 INFO - PROCESS | 20723 | colorDepth:24 10:02:33 INFO - PROCESS | 20723 | Browser inner width/height: 1024/697 10:02:33 INFO - PROCESS | 20723 | __metrics 10:02:34 ERROR - PROCESS | 20723 | JavaScript error: chrome://browser/content/tabbrowser.xml, line 2983: TypeError: this.tabs is undefined 10:02:35 INFO - TEST-INFO | 20723: exit 0 10:02:35 INFO - Browser initialized. 10:02:35 INFO - Running cycle 1/1 for dromaeo_css test... 10:02:35 INFO - TEST-INFO | started process 20846 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmp3Rr67l/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 10:02:47 INFO - PROCESS | 20846 | RSS: Main: 163778560 10:02:47 INFO - PROCESS | 20846 | 10:03:36 INFO - PROCESS | 20846 | 1470848616847 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] 10:05:46 INFO - PROCESS | 20846 | Cycle 1(1): loaded http://localhost:33760/tests/dromaeo/cssquery-dojo.html (next: http://localhost:33760/tests/dromaeo/cssquery-ext.html) 10:05:47 INFO - PROCESS | 20846 | RSS: Main: 167821312 10:05:47 INFO - PROCESS | 20846 | 10:08:49 INFO - PROCESS | 20846 | Cycle 1(1): loaded http://localhost:33760/tests/dromaeo/cssquery-ext.html (next: http://localhost:33760/tests/dromaeo/cssquery-jquery.html) 10:08:50 INFO - PROCESS | 20846 | RSS: Main: 165027840 10:08:50 INFO - PROCESS | 20846 | 10:11:51 INFO - PROCESS | 20846 | Cycle 1(1): loaded http://localhost:33760/tests/dromaeo/cssquery-jquery.html (next: http://localhost:33760/tests/dromaeo/cssquery-mootools.html) 10:11:52 INFO - PROCESS | 20846 | RSS: Main: 168267776 10:11:52 INFO - PROCESS | 20846 | 10:14:54 INFO - PROCESS | 20846 | Cycle 1(1): loaded http://localhost:33760/tests/dromaeo/cssquery-mootools.html (next: http://localhost:33760/tests/dromaeo/cssquery-prototype.html) 10:14:55 INFO - PROCESS | 20846 | RSS: Main: 162185216 10:14:55 INFO - PROCESS | 20846 | 10:17:57 INFO - PROCESS | 20846 | Cycle 1(1): loaded http://localhost:33760/tests/dromaeo/cssquery-prototype.html (next: http://localhost:33760/tests/dromaeo/cssquery-yui.html) 10:17:58 INFO - PROCESS | 20846 | RSS: Main: 165199872 10:17:58 INFO - PROCESS | 20846 | 10:21:00 INFO - PROCESS | 20846 | Cycle 1(1): loaded http://localhost:33760/tests/dromaeo/cssquery-yui.html (next: http://localhost:33760/tests/dromaeo/cssquery-dojo.html) 10:21:01 INFO - PROCESS | 20846 | RSS: Main: 169402368 10:21:01 INFO - PROCESS | 20846 | 10:21:01 INFO - PROCESS | 20846 | __start_tp_report 10:21:01 INFO - PROCESS | 20846 | _x_x_mozilla_page_load 10:21:01 INFO - PROCESS | 20846 | _x_x_mozilla_page_load_details 10:21:01 INFO - PROCESS | 20846 | |i|pagename|runs| 10:21:01 INFO - PROCESS | 20846 | |0;dojo.html;3082.059971708629;3082.1524080877757;3084.3214492811576;3107.2853243753934;3113.4862747646625;5235.424103348629;5255.185446255827;5335.973320133398;5344.599155063366;5380.112281473552;5200.453952335007;5213.765380557875;5213.843584692456;5230.6600070995355;5248.186531087687;4716.198246298129;4791.257355109963;4814.711117332954;4816.820957258216;4860;4818.036392721452;4851.563359297663;4857.392825896763;4871.415430148387;4920.8277710280145;4758.381410416624;4789.664723469358;4803.495632958559;4867.415910090794;4871.196252618313;4844.903101937942;4845.733484658343;4848.903021939542;4853.733044682541;4906.509349065101;4811.374521312207;4813.15769740294;4814.422269327703;4816.686915350526;4850.2724591311235;5153.0466863630345;5232.73836308183;5271.578273738091;5290.365156181244;5291.947080529184;5610.186522954149;5615;5626.774929002835;5694.032014557535;5695.515881150107;5713.857153571153;5720.342160651537;5732.971335143297;5739.139129130622;5744.856378590527;5274.05067087924;5309.787608495694;5319.494648008472;5320.334958130234;5326.414094449608;5761.654300741969;5776.797812076557;5796.304443466811;5797.8550536236935;5820.097884827858;5510.724463776795;5536.972315138399;5585.69278689676;5591.832245032656;5612.270404847343;5482.671039737628;5653.123765816305;5668.319801623749;5691.4877661010705;5733.88532229353;5496.6701997880255;5562.054450743383;5573.359063707726;5582.748776305076;5582.888342233214;5538.972305138448;5583;5654.095344744904;5658.603897727202;5731.226284451629;4359.629431498295;4371.912561748747;4376.912461750747;4382.496012958487;4407.272799987966;3830.4637350770913;3850.614938506127;3856.749311294757;3871.1483473636317;3891.630295121959;5432.48391402824;5461.9453805461435;5473.753681084281;5515.227868098469;5519.448055194448;5590.049691552445;5657.8019769307875;5662.178984047372;5665.093585026376;5677.347105082886;5293.047251494768;5463.344398672185;5474.124140137559;5477.3427188737605;5524.972375138099;4897.3878265216845;4937.679050861682;4940.925886111711;4966.379202599675;4998.600111991032;5897.9115313271195;5945.851353716105;5947.256592925884;5950.434708702666;5952.702364881825;5529.917051244154;5646.35066967304;5679.204911312502;5690.857728556819;5696.430356964436;5775.8556036099435;5790.160426738184;5816.592838501264;5883.146943693226;5894.970525147347;5518.917216241679;5546.417626149358;5549.250851135206;5554.638948468337;5561.694106824163;5591.692456914746;5667.914981275202;5674.886502269849;5677.5457963362005;5689.459501347365;5451.56387488992;5464.836054918359;5478.479544443271;5553.194786755978;5574.386817450159;5468.72656367188;5509.531689806411;5517.420670829505;5518.255035570147;5527.751251193787;5486.753096110605;5495.477929596682;5508.807191748269;5509.696966666872;5553.72231388437;5334.75993580282;5515.338159420895;5536.474034966672;5565.220869078251;5618.85952851182;5398.46015398457;5454.672719636835;5472.835814925558;5479.561635069105;5491.423400543045 10:21:01 INFO - PROCESS | 20846 | |1;ext.html;560.2240896358545;577.2351634084837;589.0927970924776;604.0637012630423;623.906414037894;42217.57782422175;43385.13229735404;43432.56567434325;43449.131017379674;43471.652834716515;43900.12199756003;44186;44348;44474.77762611191;44718.776406118006;8895.911040889589;9011.864822027675;9025.638974441015;9027.684031058914;9036.954815225947;8823.77940551485;8860.24687901529;8932.955335223314;8933;8948.105189481032;8940.552972351357;8992.325575581857;8997.460152390844;9002.054784247657;9024.954875225614;8946.552672366388;8969.551522423853;8978.147076027766;8979.326550508738;8990.05604411534;8795.824083518357;8905.465672059698;8915.108489151098;8946.59740311681;8970.147835955573;41469;41774;41808.58191418077;41872.79063604693;42094.36858447126;3378.8817391391185;3419.384510788057;3460.757746957714;3468.7051600613977;3893.299206142893;32451.350972980643;32639.347213055607;32920.506192407134;34088;34953.47569786455;4273.67947403946;4397.252467080572;4430.357598148283;4476.440444944382;4480.126375356806;350790;351433;354251;354958;355890.99999999744;59170.70414647985;59552.70223648854;59800;60055.699721501114;60144.699276504216;36164.638353616654;36648;36985.26029479395;57626.7118664404;57923.13115303274;14776.852231477762;14799.92600036993;14804;14816.481423150353;14886.851131488764;11271.549138034386;11290.661280161608;11398.259113157617;11401.828972565418;11403.828942565868;18949.62100757977;18955;19002;19122.904385477985;19195.712064319046;6973.58158510491;7258.129024516986;7281.963590182121;7434.888476672854;7458.4033277337685;934.4486752815872;989.2877128467492;995.4077323992213;1020.8264595018865;1113.504490501735;31603.20991975173;33192.38376617874;33219.3356132876;33340.333193335995;33363.83318083394;1097.5829184909683;1098.1544210957518;1101.2951710905027;1126.414264582429;1137.8862113788555;16961.15194240283;17431.912840435718;17527.29890804379;17592.560185995197;17603.911980440014;572576;574455;578310;579421;579476;59308;59428.70285648544;59450;59949;60119.699401502716;1284.05621867927;1333.8399392073013;1360.0955364682573;1360.9659758506314;1364.4542183126828;30854.53718194184;33035;33246;33270.16824579405;33584.32831343311;50842;52081.218781719064;52109.47890521046;52125;52186;475427;481310;482445;482796;483554;29227;29237.269068273465;29414.558781617863;29603.259918502208;29637.25906852346;48037.279440809114;48816.267755982975;49035;49520;49922.75038624783;41441.58558414377;41921.580784192985;41926.37110443407;42230.366544501245;43024.354634681134;41689.79155104205;41921.58078419177;42278.788606056776;42336.78831605822;42663;42369.788151059045;42582;43357.78321108374;43571.78214108909;45655.08689826119;32681.836590816893;38320;38920.41619375655;39045.80477097596;39080.609193907694;29405.26486837846;29433;29437.55843662304;29713.702862971957;29730.702692972794 10:21:01 INFO - PROCESS | 20846 | |2;jquery.html;385.8572328238554;387.46336324190986;401.56831406238297;404.1371671481387;418.1532396896285;18377.724334135;19942.70085948712;19988.90005549974;20101.497462563406;20312.492187695316;17371.305147794104;18076.096195190254;18137.727934081;18221.36225232117;18508.814911850877;5268.762905669245;5384.300040994665;5719.199312096289;5915.1718759373725;5991.460768530831;5829.679367634779;5886.264216972879;5905.143754155645;5918.260217472816;5921.526277897758;5316.362036555619;5519;5574.721263936807;5637;5916.201312822757;5406.02691515527;5467;5487.725613719298;5507.449255074481;5553.944460555384;5579.497845193911;5723.828285151452;5729.684867332295;5734.942650573525;5745.971270143665;14674.926625366805;23332.65001024986;23718;23735.762642373702;24165.637515437284;2304.481491664379;2307.787544880525;2953.7489313408387;2954.1580649514785;2959.9112026639236;10030.348027378197;10108.595656173744;10244.385336879812;10294.382337059726;11298.548058077668;1865.8134186581233;1909.2076788132908;1927.026851440028;1944.1737261663736;2002.499375156211;76937.23062769357;80576.99999999942;84588;88357;90245;10832.78334433307;10930.63367079115;11037.889621103686;11055.899379117942;11201.383923884265;15714.764278535831;15733.606659833596;15745.212739362985;15769.132697701736;15777.132257725936;7684.615769211517;7858.567778772108;7892.881606775903;8057.194280572013;8114.715984940617;7473.738419155304;7481.139668938033;7558;7763.650635721406;7772;4658.161530924398;4702.52974702527;4752.1921273383605;4845.2732090186755;4854.199057155601;1964.528513156832;1974.575466274729;2029.8173164415273;2044.2947183221765;2074.346580827035;929.3540989012706;1036.3522798251092;1054.1365893998563;1058.9364638121738;1072.780080083581;18610.81389186118;20205.797942020392;20264.18943242254;20360.79639203589;20533.48666283325;983.955721992512;1002.4135880509838;1004.2668851738272;1010.3634710132717;1018.7554986803113;10686.305390149615;11232.3260604364;11243.94378028121;11262.493187806569;11330.490127944262;467000;467687.66156169004;477250;525447;528274;95619.52190239004;96758.51620741992;97964.51017744865;98079.50960245154;98663;942.3968660057569;988.5008070924138;990.1237404896574;990.3711143423834;997.0627610046533;16905.408310709066;16919.23863426124;17218.913905430392;17788.110594470483;18126.81873181304;36766;39913;42596;43899.561004390824;44056.339154912064;60153.69923150356;62033;62871.6856415715;64367.67816160889;66395.00407493796;7372.889406658797;7831.647575859214;7940.801479963047;8124.146964568635;8342.79029540701;12450;13402.195868247936;13639.863601364257;13658.521951731642;13807.378667959765;11499.425028748696;11530.82703759461;11620.418979051183;11627.941860290644;12091.39543022863;11243.156763242952;11320.943345296888;11333.433328333715;11406.600768973047;11491.195616307112;11552.42237888119;11571.710707232387;11592.88407115918;11937.761244774882;12243.571474998333;7535.171131175457;7576.696932122653;7692.461527693232;7899.960500197462;8007.959960200162;10501.31741436804;11780.234284771463;11913.702157446132;11916.880831191576;11956.163068585463 10:21:01 INFO - PROCESS | 20846 | |3;mootools.html;1471.6762312291296;1492.47763282851;1611.30713793069;1750.4311098892863;1756.6223261998668;7804.531728096318;8444.66221351146;8818.691345802898;9104.36269461138;9113;8919.286457083434;9198.862017069749;9227;9230.769230769234;9247.07529247075;2366.7633236676324;2426.7694569015916;2428.6357046443086;2428.86641234732;2432.598621227495;2375.7267914189915;2378.8096952243864;2426.2478631624253;2445.535348283829;2446.694163229596;2386.653935179398;2430.793382562484;2432.5499782540196;2443.315871555967;2450.4486490539666;2376.310869847742;2387.0451819272257;2390.103711108334;2407.9157229496973;2430.2344761400277;2358.9410264743346;2360.5514952159033;2367.597508423572;2375.7267914189742;2377.750336214707;9196.448213107167;9299.070092990714;9304.953475232649;9336.206422454099;9340.486273254968;5281.656692315026;5421.756020979065;5427.375851777057;5454.61817672763;5457.972710136424;3283.589551306087;3295.24209431832;3322.9833850830832;3350.3299340131825;3359.378514974713;1040.1834559870465;1069.0859315285475;1071.844582535528;1075.5267682219876;1081.416035340915;12953.639867813838;12995.895348895356;13004.349782510932;13030.218186908722;13037.86962130376;4550.385697930737;4615.446146462446;4794.328793968847;4812.109759694397;4834.081524510402;10684.839727404094;10747.957888001254;10762;10798;10820.35077895313;5414.214938833847;5440.238366628675;5444.774925641778;5465.9180112298345;5466.753996070186;4358.36803663467;4855.465898751135;4948.653594248368;4983.277424773388;5013.323201367842;4136.896577585524;4148.798940138763;4186.665066794649;4225.72532785368;4245.426867372865;1295.9352032398342;1299.2724074518112;1312.1667740984544;1346.8316460442445;1353.15427857589;959.2661613865398;988.2044953812107;998.0867506231862;1010.9595616175418;1012.3976234140674;6092.939070609325;6198.783042593487;6312.873742525124;6338.746450141943;6434.903476447857;957.7557722780786;966.7341481092615;994.8010397920444;1027.50679673757;1055.8099542082346;4406.294992801137;4447.266201076851;4483.2602620567895;4550.590446859798;4659.673822832437;11377.089832813355;11615.709607259718;11687.123465740104;11692.824607630722;11693.941530292293;10844.620438284623;11313.773724525628;11597.362145081932;11612;11671.649850504498;8469.153084691605;8695.173958473935;8700.912990870136;8708.433951793113;8738.650453981769;6263.123162757309;6315.179026726496;6465.547411681137;6489.091527186103;6622.602643841385;10294.227932904912;10364.844527332247;10372.948135259276;10468.110210632181;10472.790544189225;10247.897521024992;10496.370217786956;10625.521851516545;10814.837777433188;10898.12814974816;7321;7873.724419645285;8005.279524842792;8218.260356567938;8403.873941890753;8996.685116020908;9072.546372681472;9083.772905677146;9110.316726245426;9136.31477639193;7959.920400795918;8117.1071182168735;8244.051934027664;8291.253787159185;8407.033191183093;7536.472446928662;7789.805254868674;7911.683532658629;7984.720534781255;8076.353891688768;7168.247334029852;7294.489385742947;7524.247575242651;7532.359749421142;7543.35881450061;5504.394516603251;5544.500994910478;5580.21876937221;5581.441855814386;5678.602497825278;5276.894462110813;5378.865528361822;5445.891082178414;5462.481064298885;5536.003519366553 10:21:01 INFO - PROCESS | 20846 | |4;prototype.html;293.9397423528177;298.50299251745844;301.92300963254365;309.30715197956584;310.8787572846589;5502.147167189087;5524.226608274845;5574.275344205248;5578.163275508676;5600.215969764231;5503.972480137603;5528.087865502187;5539.612227144102;5553.250311207986;5586.273784408021;4110.753354798714;4124.566920473352;4170.249355116078;4206.592659945454;4218.725782824122;4194.727342722713;4203.390508376284;4205.0748835256345;4217.388478670591;4225.830966761326;4174.645155161815;4190.769507677077;4193.412922190896;4214.6838987075935;4219.649712092132;3982.880513584583;4157.563455837124;4199.790010499493;4204.5585213552595;4212.136512015029;3622.1487950331652;3627;3635.9636403636155;3648.4892115103908;3656.469811877263;5321.7605207765355;5339.813106541253;5350.571954243651;5352.57179425645;5363.1039238811;4516.725374103781;4716.8349107781405;4737.73942433166;4743.505795674351;4772.665913386064;5695.800646977377;5698.943010569883;5707.944030354356;5778.971105144489;5785.871755007775;3981.0843505993785;3998.3602623580377;4000.4999375078114;4007.5591684914634;4022.1352409231863;5872.295324561037;5966.284045914518;6030.155778191057;6035.366286539938;6044.486218671462;4075.2460794753065;4095.488063992001;4104.835806567764;4105.337338377962;4106.650934670586;4137.8965525861495;4146.771927544014;4148.543660197376;4149.875503734893;4156.649089046072;4724.645651576146;4791.377120974321;4808.855734327975;4829.227323628273;4829.613630909519;5733.397993210736;5758.782868595621;5768.855778605568;5772.797952071657;5785.421457854265;1423.8220222472191;1446.3491428857055;1447.1823419767798;1451.7241724072392;1455.3887367305756;851.923326900582;903.5527413930147;906.7642412972675;909.2589539525266;926.8748718922859;5483.150111732688;5537.6709589698185;5548.72256387179;5560.555155587544;5580.218769372291;5833.445822646841;5834.154047663065;5843.795467158629;5855.355910849803;5933.881322373529;5300.27036076421;5602.271704678447;5603.7478313475995;5655.604107712503;5670.659760414306;3155.8224824870767;3167.55654208411;3170.8097514149226;3179.9205019874225;3186.5978969253456;6068.877257707339;6176.598521096114;6230.906536401958;6253.812385628438;6268.749250030039;6026.54800889935;6048.546359023091;6064.75672487139;6090.23872015998;6100.298465676416;6116.26604807426;6170.796694644591;6202.627842329474;6251.531135164881;6290.050084473828;5664.716764161693;5812.912806307993;5830.47525722687;5832.37114012495;5960.225170727951;5905.911411328748;5918.585699001201;5940;5960.642361458326;5962.135490353961;5907.793227237026;6179.16581261524;6207.193064901534;6213.5339849512375;6256.655883926428;4109.794510274534;4142.91714165709;4145.316022856195;4146.958530414658;4150.481189851269;5964.777220669665;5971.313298970674;5973.283206015306;5983.431574000463;5993.580449368676;5735.36910939788;5778.422157784356;5805.883882322245;5836.824895253149;5840.795572154954;5768.105943578752;5808.767649293981;5823.1847541343395;5831.329397119385;5835.737391817293;5223.3209682741;5801.477866991991;5830.679312637845;5833.762261944661;5866.592017915584;5753.741081651252;5814.505767009851;5816.760547189448;5843.561732870136;5864.035548091437;5695.829125126253;5714.771409143587;5715.799682066812;5725.341585717696;5731.455511726379 10:21:01 INFO - PROCESS | 20846 | |5;yui.html;722.3101937649545;738.8152961759561;772.9989663385915;796.6335485676589;813.7571776470767;16682.83317166828;17535.2109155088;17538.29846806126;17589.120543972815;17602;14850.628734281649;14863.92568037161;14943.626409339771;14973.700525989474;14979.625509362271;648.6432462145801;750.1373420566365;761.958092304923;762.6072572625103;782.1826191629747;791.7189397763798;795.2167115391335;797.0634504457269;799.3684988858795;800.1878093734864;862.965481380744;865.4028720183054;867.7960679240374;868.5440143924427;870.4907629037021;852.2244757270885;855.0295414704356;857.1728282207699;859.1194026123211;862.4178679391417;629.2354788931425;630.6342321453592;631.1952260867384;632.0582332324803;633.1389310537666;15605.297761600756;15607.921960390238;15733.842661573466;15777.368905243777;15794.605134871605;14375.712485750331;14447.566573002827;14639;15612;15999.600009999727;12589.874101258962;12699.365031748375;12723.872761272361;12831.679208019874;13037.282949437777;3870.4581358609817;3941.408788681692;3966.087799806032;4011.237864805707;4063.97968010161;89819.55090224573;90567;90965.54517227372;92984.53507732485;94908;11793.174477786644;11935.641930742091;11955.581554645545;12046.698832529082;12129.514819407124;23895.283141505784;23931.641025384633;23943.922523486486;24103.276901692978;24104.87947560251;8463.407561470762;8582.78543036429;8639.524826134497;8745.169208925143;8837.734867953972;4691.554302341272;4733.5503127202865;4742.976285118552;4763.666543341933;4820.662553621283;3398.456247000468;3515.8593656253465;3523.3657941570764;3530.5233793437556;3534.7879127252445;563.6449037106596;565.5758181363977;571.9170720245542;580.7531798985415;587.4096532984323;731.7438896386328;733.1678544851632;750.557171268954;754.9245075492516;804.8671969125146;9580.281478888972;10431.791364172674;10600.840987385196;10626.309289896131;10746.946265268623;671.7648822912039;691.778630838127;760.8288135169543;762.1121393576532;773.05301006268;4804.711717296974;4811.566958973709;5150.510701483353;5170.069387510209;5178.844634660966;123776.38111809384;128972.35513822558;130121.34939325243;130980;131576;109108.4544577272;109425;111358.44320778507;112692;115320.42339788248;95277;97666.51166744121;98397;103595;104017.47991259996;9505.809883802147;10015.799684006424;10035.849462257926;10077.294589378966;10164.695059148238;56664.716676416356;57429.71285143548;57639.711801442405;58668.413315866295;60636.393636063076;76292.85560716705;78280.2171978273;83210.5839470823;85609.57195213984;86788;11132.721681958015;11372.488238029475;11847.822282665938;12309.26144431337;12428.56500022495;15352.616184595028;15399;15860;16034.35862565531;16241.756373654642;14703.264836758333;14887.404503819726;15260.923695381452;15622.916397145971;15644.530664080095;13554.728905422033;13712.245826479639;13947.30263486842;14374.568762937128;14698.338574763948;14595.92702036483;14692.485762998243;14794.63013424673;14967.625809354853;15141.167235802137;11265.65228236468;11368;11661.300321980709;12009.459574319351;12032.59348130395;10683.839742403714;11183.440827958408;11950.521979120738;12449.813252801034;12605 10:21:01 INFO - PROCESS | 20846 | __end_tp_report 10:21:01 INFO - PROCESS | 20846 | __start_cc_report 10:21:01 INFO - PROCESS | 20846 | _x_x_mozilla_cycle_collect,340 10:21:01 INFO - PROCESS | 20846 | __end_cc_report 10:21:01 INFO - PROCESS | 20846 | __startTimestamp1470849661105__endTimestamp 10:21:01 INFO - PROCESS | 20846 | 10:21:01 INFO - PROCESS | 20846 | ------- Summary: start ------- 10:21:01 INFO - PROCESS | 20846 | Number of tests: 6 10:21:01 INFO - PROCESS | 20846 | 10:21:01 INFO - PROCESS | 20846 | [#0] dojo.html Cycles:165 Average:5266.98 Median:5486.75 stddev:587.95 (10.7%) stddev-sans-first:564.22 10:21:01 INFO - PROCESS | 20846 | Values: 3082.1 3082.2 3084.3 3107.3 3113.5 5235.4 5255.2 5336.0 5344.6 5380.1 5200.5 5213.8 5213.8 5230.7 5248.2 4716.2 4791.3 4814.7 4816.8 4860.0 4818.0 4851.6 4857.4 4871.4 4920.8 4758.4 4789.7 4803.5 4867.4 4871.2 4844.9 4845.7 4848.9 4853.7 4906.5 4811.4 4813.2 4814.4 4816.7 4850.3 5153.0 5232.7 5271.6 5290.4 5291.9 5610.2 5615.0 5626.8 5694.0 5695.5 5713.9 5720.3 5733.0 5739.1 5744.9 5274.1 5309.8 5319.5 5320.3 5326.4 5761.7 5776.8 5796.3 5797.9 5820.1 5510.7 5537.0 5585.7 5591.8 5612.3 5482.7 5653.1 5668.3 5691.5 5733.9 5496.7 5562.1 5573.4 5582.7 5582.9 5539.0 5583.0 5654.1 5658.6 5731.2 4359.6 4371.9 4376.9 4382.5 4407.3 3830.5 3850.6 3856.7 3871.1 3891.6 5432.5 5461.9 5473.8 5515.2 5519.4 5590.0 5657.8 5662.2 5665.1 5677.3 5293.0 5463.3 5474.1 5477.3 5525.0 4897.4 4937.7 4940.9 4966.4 4998.6 5897.9 5945.9 5947.3 5950.4 5952.7 5529.9 5646.4 5679.2 5690.9 5696.4 5775.9 5790.2 5816.6 5883.1 5895.0 5518.9 5546.4 5549.3 5554.6 5561.7 5591.7 5667.9 5674.9 5677.5 5689.5 5451.6 5464.8 5478.5 5553.2 5574.4 5468.7 5509.5 5517.4 5518.3 5527.8 5486.8 5495.5 5508.8 5509.7 5553.7 5334.8 5515.3 5536.5 5565.2 5618.9 5398.5 5454.7 5472.8 5479.6 5491.4 10:21:01 INFO - PROCESS | 20846 | 10:21:01 INFO - PROCESS | 20846 | [#1] ext.html Cycles:180 Average:62676.22 Median:42622.50 stddev:127403.10 (298.9%) stddev-sans-first:127675.14 10:21:01 INFO - PROCESS | 20846 | Values: 560.2 577.2 589.1 604.1 623.9 42217.6 43385.1 43432.6 43449.1 43471.7 43900.1 44186.0 44348.0 44474.8 44718.8 8895.9 9011.9 9025.6 9027.7 9037.0 8823.8 8860.2 8933.0 8933.0 8948.1 8940.6 8992.3 8997.5 9002.1 9025.0 8946.6 8969.6 8978.1 8979.3 8990.1 8795.8 8905.5 8915.1 8946.6 8970.1 41469.0 41774.0 41808.6 41872.8 42094.4 3378.9 3419.4 3460.8 3468.7 3893.3 32451.4 32639.3 32920.5 34088.0 34953.5 4273.7 4397.3 4430.4 4476.4 4480.1 350790.0 351433.0 354251.0 354958.0 355891.0 59170.7 59552.7 59800.0 60055.7 60144.7 36164.6 36648.0 36985.3 57626.7 57923.1 14776.9 14799.9 14804.0 14816.5 14886.9 11271.5 11290.7 11398.3 11401.8 11403.8 18949.6 18955.0 19002.0 19122.9 19195.7 6973.6 7258.1 7282.0 7434.9 7458.4 934.4 989.3 995.4 1020.8 1113.5 31603.2 33192.4 33219.3 33340.3 33363.8 1097.6 1098.2 1101.3 1126.4 1137.9 16961.2 17431.9 17527.3 17592.6 17603.9 572576.0 574455.0 578310.0 579421.0 579476.0 59308.0 59428.7 59450.0 59949.0 60119.7 1284.1 1333.8 1360.1 1361.0 1364.5 30854.5 33035.0 33246.0 33270.2 33584.3 50842.0 52081.2 52109.5 52125.0 52186.0 475427.0 481310.0 482445.0 482796.0 483554.0 29227.0 29237.3 29414.6 29603.3 29637.3 48037.3 48816.3 49035.0 49520.0 49922.8 41441.6 41921.6 41926.4 42230.4 43024.4 41689.8 41921.6 42278.8 42336.8 42663.0 42369.8 42582.0 43357.8 43571.8 45655.1 32681.8 38320.0 38920.4 39045.8 39080.6 29405.3 29433.0 29437.6 29713.7 29730.7 10:21:01 INFO - PROCESS | 20846 | 10:21:01 INFO - PROCESS | 20846 | [#2] jquery.html Cycles:180 Average:29413.58 Median:2953.95 stddev:81672.46 (2764.9%) stddev-sans-first:81872.49 10:21:01 INFO - PROCESS | 20846 | Values: 385.9 387.5 401.6 404.1 418.2 18377.7 19942.7 19988.9 20101.5 20312.5 17371.3 18076.1 18137.7 18221.4 18508.8 5268.8 5384.3 5719.2 5915.2 5991.5 5829.7 5886.3 5905.1 5918.3 5921.5 5316.4 5519.0 5574.7 5637.0 5916.2 5406.0 5467.0 5487.7 5507.4 5553.9 5579.5 5723.8 5729.7 5734.9 5746.0 14674.9 23332.7 23718.0 23735.8 24165.6 2304.5 2307.8 2953.7 2954.2 2959.9 10030.3 10108.6 10244.4 10294.4 11298.5 1865.8 1909.2 1927.0 1944.2 2002.5 76937.2 80577.0 84588.0 88357.0 90245.0 10832.8 10930.6 11037.9 11055.9 11201.4 15714.8 15733.6 15745.2 15769.1 15777.1 7684.6 7858.6 7892.9 8057.2 8114.7 7473.7 7481.1 7558.0 7763.7 7772.0 4658.2 4702.5 4752.2 4845.3 4854.2 1964.5 1974.6 2029.8 2044.3 2074.3 929.4 1036.4 1054.1 1058.9 1072.8 18610.8 20205.8 20264.2 20360.8 20533.5 984.0 1002.4 1004.3 1010.4 1018.8 10686.3 11232.3 11243.9 11262.5 11330.5 467000.0 467687.7 477250.0 525447.0 528274.0 95619.5 96758.5 97964.5 98079.5 98663.0 942.4 988.5 990.1 990.4 997.1 16905.4 16919.2 17218.9 17788.1 18126.8 36766.0 39913.0 42596.0 43899.6 44056.3 60153.7 62033.0 62871.7 64367.7 66395.0 7372.9 7831.6 7940.8 8124.1 8342.8 12450.0 13402.2 13639.9 13658.5 13807.4 11499.4 11530.8 11620.4 11627.9 12091.4 11243.2 11320.9 11333.4 11406.6 11491.2 11552.4 11571.7 11592.9 11937.8 12243.6 7535.2 7576.7 7692.5 7900.0 8008.0 10501.3 11780.2 11913.7 11916.9 11956.2 10:21:01 INFO - PROCESS | 20846 | 10:21:01 INFO - PROCESS | 20846 | [#3] mootools.html Cycles:180 Average:6062.75 Median:4637.56 stddev:3464.41 (74.7%) stddev-sans-first:3456.95 10:21:01 INFO - PROCESS | 20846 | Values: 1471.7 1492.5 1611.3 1750.4 1756.6 7804.5 8444.7 8818.7 9104.4 9113.0 8919.3 9198.9 9227.0 9230.8 9247.1 2366.8 2426.8 2428.6 2428.9 2432.6 2375.7 2378.8 2426.2 2445.5 2446.7 2386.7 2430.8 2432.5 2443.3 2450.4 2376.3 2387.0 2390.1 2407.9 2430.2 2358.9 2360.6 2367.6 2375.7 2377.8 9196.4 9299.1 9305.0 9336.2 9340.5 5281.7 5421.8 5427.4 5454.6 5458.0 3283.6 3295.2 3323.0 3350.3 3359.4 1040.2 1069.1 1071.8 1075.5 1081.4 12953.6 12995.9 13004.3 13030.2 13037.9 4550.4 4615.4 4794.3 4812.1 4834.1 10684.8 10748.0 10762.0 10798.0 10820.4 5414.2 5440.2 5444.8 5465.9 5466.8 4358.4 4855.5 4948.7 4983.3 5013.3 4136.9 4148.8 4186.7 4225.7 4245.4 1295.9 1299.3 1312.2 1346.8 1353.2 959.3 988.2 998.1 1011.0 1012.4 6092.9 6198.8 6312.9 6338.7 6434.9 957.8 966.7 994.8 1027.5 1055.8 4406.3 4447.3 4483.3 4550.6 4659.7 11377.1 11615.7 11687.1 11692.8 11693.9 10844.6 11313.8 11597.4 11612.0 11671.6 8469.2 8695.2 8700.9 8708.4 8738.7 6263.1 6315.2 6465.5 6489.1 6622.6 10294.2 10364.8 10372.9 10468.1 10472.8 10247.9 10496.4 10625.5 10814.8 10898.1 7321.0 7873.7 8005.3 8218.3 8403.9 8996.7 9072.5 9083.8 9110.3 9136.3 7959.9 8117.1 8244.1 8291.3 8407.0 7536.5 7789.8 7911.7 7984.7 8076.4 7168.2 7294.5 7524.2 7532.4 7543.4 5504.4 5544.5 5580.2 5581.4 5678.6 5276.9 5378.9 5445.9 5462.5 5536.0 10:21:01 INFO - PROCESS | 20846 | 10:21:01 INFO - PROCESS | 20846 | [#4] prototype.html Cycles:180 Average:4838.40 Median:5593.24 stddev:1467.02 (26.2%) stddev-sans-first:1430.94 10:21:01 INFO - PROCESS | 20846 | Values: 293.9 298.5 301.9 309.3 310.9 5502.1 5524.2 5574.3 5578.2 5600.2 5504.0 5528.1 5539.6 5553.3 5586.3 4110.8 4124.6 4170.2 4206.6 4218.7 4194.7 4203.4 4205.1 4217.4 4225.8 4174.6 4190.8 4193.4 4214.7 4219.6 3982.9 4157.6 4199.8 4204.6 4212.1 3622.1 3627.0 3636.0 3648.5 3656.5 5321.8 5339.8 5350.6 5352.6 5363.1 4516.7 4716.8 4737.7 4743.5 4772.7 5695.8 5698.9 5707.9 5779.0 5785.9 3981.1 3998.4 4000.5 4007.6 4022.1 5872.3 5966.3 6030.2 6035.4 6044.5 4075.2 4095.5 4104.8 4105.3 4106.7 4137.9 4146.8 4148.5 4149.9 4156.6 4724.6 4791.4 4808.9 4829.2 4829.6 5733.4 5758.8 5768.9 5772.8 5785.4 1423.8 1446.3 1447.2 1451.7 1455.4 851.9 903.6 906.8 909.3 926.9 5483.2 5537.7 5548.7 5560.6 5580.2 5833.4 5834.2 5843.8 5855.4 5933.9 5300.3 5602.3 5603.7 5655.6 5670.7 3155.8 3167.6 3170.8 3179.9 3186.6 6068.9 6176.6 6230.9 6253.8 6268.7 6026.5 6048.5 6064.8 6090.2 6100.3 6116.3 6170.8 6202.6 6251.5 6290.1 5664.7 5812.9 5830.5 5832.4 5960.2 5905.9 5918.6 5940.0 5960.6 5962.1 5907.8 6179.2 6207.2 6213.5 6256.7 4109.8 4142.9 4145.3 4147.0 4150.5 5964.8 5971.3 5973.3 5983.4 5993.6 5735.4 5778.4 5805.9 5836.8 5840.8 5768.1 5808.8 5823.2 5831.3 5835.7 5223.3 5801.5 5830.7 5833.8 5866.6 5753.7 5814.5 5816.8 5843.6 5864.0 5695.8 5714.8 5715.8 5725.3 5731.5 10:21:01 INFO - PROCESS | 20846 | 10:21:01 INFO - PROCESS | 20846 | [#5] yui.html Cycles:180 Average:23123.90 Median:3457.16 stddev:34243.94 (990.5%) stddev-sans-first:34298.69 10:21:01 INFO - PROCESS | 20846 | Values: 722.3 738.8 773.0 796.6 813.8 16682.8 17535.2 17538.3 17589.1 17602.0 14850.6 14863.9 14943.6 14973.7 14979.6 648.6 750.1 762.0 762.6 782.2 791.7 795.2 797.1 799.4 800.2 863.0 865.4 867.8 868.5 870.5 852.2 855.0 857.2 859.1 862.4 629.2 630.6 631.2 632.1 633.1 15605.3 15607.9 15733.8 15777.4 15794.6 14375.7 14447.6 14639.0 15612.0 15999.6 12589.9 12699.4 12723.9 12831.7 13037.3 3870.5 3941.4 3966.1 4011.2 4064.0 89819.6 90567.0 90965.5 92984.5 94908.0 11793.2 11935.6 11955.6 12046.7 12129.5 23895.3 23931.6 23943.9 24103.3 24104.9 8463.4 8582.8 8639.5 8745.2 8837.7 4691.6 4733.6 4743.0 4763.7 4820.7 3398.5 3515.9 3523.4 3530.5 3534.8 563.6 565.6 571.9 580.8 587.4 731.7 733.2 750.6 754.9 804.9 9580.3 10431.8 10600.8 10626.3 10746.9 671.8 691.8 760.8 762.1 773.1 4804.7 4811.6 5150.5 5170.1 5178.8 123776.4 128972.4 130121.3 130980.0 131576.0 109108.5 109425.0 111358.4 112692.0 115320.4 95277.0 97666.5 98397.0 103595.0 104017.5 9505.8 10015.8 10035.8 10077.3 10164.7 56664.7 57429.7 57639.7 58668.4 60636.4 76292.9 78280.2 83210.6 85609.6 86788.0 11132.7 11372.5 11847.8 12309.3 12428.6 15352.6 15399.0 15860.0 16034.4 16241.8 14703.3 14887.4 15260.9 15622.9 15644.5 13554.7 13712.2 13947.3 14374.6 14698.3 14595.9 14692.5 14794.6 14967.6 15141.2 11265.7 11368.0 11661.3 12009.5 12032.6 10683.8 11183.4 11950.5 12449.8 12605.0 10:21:01 INFO - PROCESS | 20846 | -------- Summary: end -------- 10:21:01 INFO - PROCESS | 20846 | 10:21:01 INFO - TEST-INFO | 20846: exit 0 10:21:01 INFO - TEST-OK | dromaeo_css | took 1113020ms 10:21:01 INFO - TEST-START | kraken 10:21:01 INFO - operating with platform_type : linux_ 10:21:01 INFO - Initialising browser for kraken test... 10:21:01 INFO - TEST-INFO | started process 21094 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpYu5v02/profile http://localhost:33760/getInfo.html) 10:21:06 INFO - PROCESS | 21094 | __metrics Screen width/height:1600/1200 10:21:06 INFO - PROCESS | 21094 | colorDepth:24 10:21:06 INFO - PROCESS | 21094 | Browser inner width/height: 1024/697 10:21:06 INFO - PROCESS | 21094 | __metrics 10:21:07 ERROR - PROCESS | 21094 | JavaScript error: chrome://browser/content/tabbrowser.xml, line 2983: TypeError: this.tabs is undefined 10:21:08 INFO - TEST-INFO | 21094: exit 0 10:21:08 INFO - Browser initialized. 10:21:08 INFO - Running cycle 1/1 for kraken test... 10:21:08 INFO - TEST-INFO | started process 21215 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpYu5v02/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 10:21:19 INFO - PROCESS | 21215 | RSS: Main: 162893824 10:21:19 INFO - PROCESS | 21215 | 10:21:22 INFO - PROCESS | 21215 | Cycle 1(1): loaded http://localhost:33760/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:33760/tests/kraken/driver.html?testName=audio-beat-detection) 10:21:23 INFO - PROCESS | 21215 | RSS: Main: 168587264 10:21:23 INFO - PROCESS | 21215 | 10:21:25 INFO - PROCESS | 21215 | Cycle 1(1): loaded http://localhost:33760/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:33760/tests/kraken/driver.html?testName=audio-dft) 10:21:26 INFO - PROCESS | 21215 | RSS: Main: 167391232 10:21:26 INFO - PROCESS | 21215 | 10:21:29 INFO - PROCESS | 21215 | Cycle 1(1): loaded http://localhost:33760/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:33760/tests/kraken/driver.html?testName=audio-fft) 10:21:30 INFO - PROCESS | 21215 | RSS: Main: 163643392 10:21:30 INFO - PROCESS | 21215 | 10:21:32 INFO - PROCESS | 21215 | Cycle 1(1): loaded http://localhost:33760/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:33760/tests/kraken/driver.html?testName=audio-oscillator) 10:21:32 INFO - PROCESS | 21215 | RSS: Main: 164687872 10:21:32 INFO - PROCESS | 21215 | 10:21:34 INFO - PROCESS | 21215 | Cycle 1(1): loaded http://localhost:33760/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:33760/tests/kraken/driver.html?testName=imaging-gaussian-blur) 10:21:35 INFO - PROCESS | 21215 | RSS: Main: 164646912 10:21:35 INFO - PROCESS | 21215 | 10:21:38 INFO - PROCESS | 21215 | Cycle 1(1): loaded http://localhost:33760/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:33760/tests/kraken/driver.html?testName=imaging-darkroom) 10:21:39 INFO - PROCESS | 21215 | RSS: Main: 164663296 10:21:39 INFO - PROCESS | 21215 | 10:21:42 INFO - PROCESS | 21215 | Cycle 1(1): loaded http://localhost:33760/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:33760/tests/kraken/driver.html?testName=imaging-desaturate) 10:21:43 INFO - PROCESS | 21215 | RSS: Main: 163074048 10:21:43 INFO - PROCESS | 21215 | 10:21:46 INFO - PROCESS | 21215 | Cycle 1(1): loaded http://localhost:33760/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:33760/tests/kraken/driver.html?testName=json-parse-financial) 10:21:46 INFO - PROCESS | 21215 | RSS: Main: 164204544 10:21:46 INFO - PROCESS | 21215 | 10:21:48 INFO - PROCESS | 21215 | Cycle 1(1): loaded http://localhost:33760/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:33760/tests/kraken/driver.html?testName=json-stringify-tinderbox) 10:21:49 INFO - PROCESS | 21215 | RSS: Main: 164368384 10:21:49 INFO - PROCESS | 21215 | 10:21:50 INFO - PROCESS | 21215 | Cycle 1(1): loaded http://localhost:33760/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:33760/tests/kraken/driver.html?testName=stanford-crypto-aes) 10:21:51 INFO - PROCESS | 21215 | RSS: Main: 164417536 10:21:51 INFO - PROCESS | 21215 | 10:21:53 INFO - PROCESS | 21215 | Cycle 1(1): loaded http://localhost:33760/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:33760/tests/kraken/driver.html?testName=stanford-crypto-ccm) 10:21:54 INFO - PROCESS | 21215 | RSS: Main: 165306368 10:21:54 INFO - PROCESS | 21215 | 10:21:56 INFO - PROCESS | 21215 | Cycle 1(1): loaded http://localhost:33760/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:33760/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 10:21:57 INFO - PROCESS | 21215 | RSS: Main: 165273600 10:21:57 INFO - PROCESS | 21215 | 10:22:00 INFO - PROCESS | 21215 | Cycle 1(1): loaded http://localhost:33760/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:33760/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 10:22:00 INFO - PROCESS | 21215 | RSS: Main: 165273600 10:22:00 INFO - PROCESS | 21215 | 10:22:02 INFO - PROCESS | 21215 | Cycle 1(1): loaded http://localhost:33760/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:33760/tests/kraken/driver.html?testName=ai-astar) 10:22:02 INFO - PROCESS | 21215 | RSS: Main: 166371328 10:22:02 INFO - PROCESS | 21215 | 10:22:02 INFO - PROCESS | 21215 | __start_tp_report 10:22:02 INFO - PROCESS | 21215 | _x_x_mozilla_page_load 10:22:02 INFO - PROCESS | 21215 | _x_x_mozilla_page_load_details 10:22:02 INFO - PROCESS | 21215 | |i|pagename|runs| 10:22:02 INFO - PROCESS | 21215 | |0;ai-astar;102;113;107;112;113;114;115;112;112;114 10:22:02 INFO - PROCESS | 21215 | |1;audio-beat-detection;147;117;142;172;124;147;149;120;182;118 10:22:02 INFO - PROCESS | 21215 | |2;audio-dft;162;162;163;162;162;165;177;162;165;163 10:22:02 INFO - PROCESS | 21215 | |3;audio-fft;75;75;76;173;75;75;79;75;169;76 10:22:02 INFO - PROCESS | 21215 | |4;audio-oscillator;85;84;151;85;84;86;147;83;83;143 10:22:02 INFO - PROCESS | 21215 | |5;imaging-gaussian-blur;117;117;118;122;118;118;118;118;118;118 10:22:02 INFO - PROCESS | 21215 | |6;imaging-darkroom;148;148;148;147;150;147;148;146;147;147 10:22:02 INFO - PROCESS | 21215 | |7;imaging-desaturate;95;97;96;95;95;98;96;97;96;95 10:22:02 INFO - PROCESS | 21215 | |8;json-parse-financial;52;51;51;51;51;54;60;51;51;51 10:22:02 INFO - PROCESS | 21215 | |9;json-stringify-tinderbox;60;61;61;61;61;60;61;62;61;62 10:22:02 INFO - PROCESS | 21215 | |10;stanford-crypto-aes;78;76;77;78;77;77;81;75;81;76 10:22:02 INFO - PROCESS | 21215 | |11;stanford-crypto-ccm;131;124;132;123;130;123;126;126;139;134 10:22:02 INFO - PROCESS | 21215 | |12;stanford-crypto-pbkdf2;173;169;161;164;166;159;162;160;159;160 10:22:02 INFO - PROCESS | 21215 | |13;stanford-crypto-sha256-iterative;72;75;65;65;64;65;64;64;63;62 10:22:02 INFO - PROCESS | 21215 | __end_tp_report 10:22:02 INFO - PROCESS | 21215 | __start_cc_report 10:22:02 INFO - PROCESS | 21215 | _x_x_mozilla_cycle_collect,820 10:22:02 INFO - PROCESS | 21215 | __end_cc_report 10:22:02 INFO - PROCESS | 21215 | __startTimestamp1470849722801__endTimestamp 10:22:02 INFO - PROCESS | 21215 | 10:22:02 INFO - PROCESS | 21215 | ------- Summary: start ------- 10:22:02 INFO - PROCESS | 21215 | Number of tests: 14 10:22:02 INFO - PROCESS | 21215 | 10:22:02 INFO - PROCESS | 21215 | [#0] ai-astar Cycles:10 Average:111.40 Median:113.00 stddev:3.95 (3.5%) stddev-sans-first:2.30 10:22:02 INFO - PROCESS | 21215 | Values: 102.0 113.0 107.0 112.0 113.0 114.0 115.0 112.0 112.0 114.0 10:22:02 INFO - PROCESS | 21215 | 10:22:02 INFO - PROCESS | 21215 | [#1] audio-beat-detection Cycles:10 Average:141.80 Median:147.00 stddev:22.63 (15.4%) stddev-sans-first:23.92 10:22:02 INFO - PROCESS | 21215 | Values: 147.0 117.0 142.0 172.0 124.0 147.0 149.0 120.0 182.0 118.0 10:22:02 INFO - PROCESS | 21215 | 10:22:02 INFO - PROCESS | 21215 | [#2] audio-dft Cycles:10 Average:164.30 Median:163.00 stddev:4.62 (2.8%) stddev-sans-first:4.82 10:22:02 INFO - PROCESS | 21215 | Values: 162.0 162.0 163.0 162.0 162.0 165.0 177.0 162.0 165.0 163.0 10:22:02 INFO - PROCESS | 21215 | 10:22:02 INFO - PROCESS | 21215 | [#3] audio-fft Cycles:10 Average:94.80 Median:75.00 stddev:40.19 (53.6%) stddev-sans-first:41.99 10:22:02 INFO - PROCESS | 21215 | Values: 75.0 75.0 76.0 173.0 75.0 75.0 79.0 75.0 169.0 76.0 10:22:02 INFO - PROCESS | 21215 | 10:22:02 INFO - PROCESS | 21215 | [#4] audio-oscillator Cycles:10 Average:103.10 Median:84.00 stddev:30.37 (36.2%) stddev-sans-first:31.49 10:22:02 INFO - PROCESS | 21215 | Values: 85.0 84.0 151.0 85.0 84.0 86.0 147.0 83.0 83.0 143.0 10:22:02 INFO - PROCESS | 21215 | 10:22:02 INFO - PROCESS | 21215 | [#5] imaging-gaussian-blur Cycles:10 Average:118.20 Median:118.00 stddev:1.40 (1.2%) stddev-sans-first:1.41 10:22:02 INFO - PROCESS | 21215 | Values: 117.0 117.0 118.0 122.0 118.0 118.0 118.0 118.0 118.0 118.0 10:22:02 INFO - PROCESS | 21215 | 10:22:02 INFO - PROCESS | 21215 | [#6] imaging-darkroom Cycles:10 Average:147.60 Median:148.00 stddev:1.07 (0.7%) stddev-sans-first:1.13 10:22:02 INFO - PROCESS | 21215 | Values: 148.0 148.0 148.0 147.0 150.0 147.0 148.0 146.0 147.0 147.0 10:22:02 INFO - PROCESS | 21215 | 10:22:02 INFO - PROCESS | 21215 | [#7] imaging-desaturate Cycles:10 Average:96.00 Median:96.00 stddev:1.05 (1.1%) stddev-sans-first:1.05 10:22:02 INFO - PROCESS | 21215 | Values: 95.0 97.0 96.0 95.0 95.0 98.0 96.0 97.0 96.0 95.0 10:22:02 INFO - PROCESS | 21215 | 10:22:02 INFO - PROCESS | 21215 | [#8] json-parse-financial Cycles:10 Average:52.30 Median:51.00 stddev:2.87 (5.6%) stddev-sans-first:3.04 10:22:02 INFO - PROCESS | 21215 | Values: 52.0 51.0 51.0 51.0 51.0 54.0 60.0 51.0 51.0 51.0 10:22:02 INFO - PROCESS | 21215 | 10:22:02 INFO - PROCESS | 21215 | [#9] json-stringify-tinderbox Cycles:10 Average:61.00 Median:61.00 stddev:0.67 (1.1%) stddev-sans-first:0.60 10:22:02 INFO - PROCESS | 21215 | Values: 60.0 61.0 61.0 61.0 61.0 60.0 61.0 62.0 61.0 62.0 10:22:02 INFO - PROCESS | 21215 | 10:22:02 INFO - PROCESS | 21215 | [#10] stanford-crypto-aes Cycles:10 Average:77.60 Median:77.50 stddev:2.01 (2.6%) stddev-sans-first:2.13 10:22:02 INFO - PROCESS | 21215 | Values: 78.0 76.0 77.0 78.0 77.0 77.0 81.0 75.0 81.0 76.0 10:22:02 INFO - PROCESS | 21215 | 10:22:02 INFO - PROCESS | 21215 | [#11] stanford-crypto-ccm Cycles:10 Average:128.80 Median:130.50 stddev:5.31 (4.1%) stddev-sans-first:5.57 10:22:02 INFO - PROCESS | 21215 | Values: 131.0 124.0 132.0 123.0 130.0 123.0 126.0 126.0 139.0 134.0 10:22:02 INFO - PROCESS | 21215 | 10:22:02 INFO - PROCESS | 21215 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:163.30 Median:163.00 stddev:4.72 (2.9%) stddev-sans-first:3.46 10:22:02 INFO - PROCESS | 21215 | Values: 173.0 169.0 161.0 164.0 166.0 159.0 162.0 160.0 159.0 160.0 10:22:02 INFO - PROCESS | 21215 | 10:22:02 INFO - PROCESS | 21215 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:65.90 Median:65.00 stddev:4.18 (6.4%) stddev-sans-first:3.80 10:22:02 INFO - PROCESS | 21215 | Values: 72.0 75.0 65.0 65.0 64.0 65.0 64.0 64.0 63.0 62.0 10:22:02 INFO - PROCESS | 21215 | -------- Summary: end -------- 10:22:02 INFO - PROCESS | 21215 | 10:22:03 INFO - TEST-INFO | 21215: exit 0 10:22:03 INFO - TEST-OK | kraken | took 62004ms 10:22:03 INFO - SUITE-END | took 1175s 10:22:03 INFO - Completed test suite (00:19:35) 10:22:03 INFO - javascript benchmark 10:22:04 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"extraOptions": ["e10s"], "name": "dromaeo_css", "lowerIsBetter": false, "alertThreshold": 5.0, "value": 7389.699727251123, "subtests": [{"name": "dojo.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [3082.059971708629, 3082.1524080877757, 3084.3214492811576, 3107.2853243753934, 3113.4862747646625, 5235.424103348629, 5255.185446255827, 5335.973320133398, 5344.599155063366, 5380.112281473552, 5200.453952335007, 5213.765380557875, 5213.843584692456, 5230.6600070995355, 5248.186531087687, 4716.198246298129, 4791.257355109963, 4814.711117332954, 4816.820957258216, 4860.0, 4818.036392721452, 4851.563359297663, 4857.392825896763, 4871.415430148387, 4920.8277710280145, 4758.381410416624, 4789.664723469358, 4803.495632958559, 4867.415910090794, 4871.196252618313, 4844.903101937942, 4845.733484658343, 4848.903021939542, 4853.733044682541, 4906.509349065101, 4811.374521312207, 4813.15769740294, 4814.422269327703, 4816.686915350526, 4850.2724591311235, 5153.0466863630345, 5232.73836308183, 5271.578273738091, 5290.365156181244, 5291.947080529184, 5610.186522954149, 5615.0, 5626.774929002835, 5694.032014557535, 5695.515881150107, 5713.857153571153, 5720.342160651537, 5732.971335143297, 5739.139129130622, 5744.856378590527, 5274.05067087924, 5309.787608495694, 5319.494648008472, 5320.334958130234, 5326.414094449608, 5761.654300741969, 5776.797812076557, 5796.304443466811, 5797.8550536236935, 5820.097884827858, 5510.724463776795, 5536.972315138399, 5585.69278689676, 5591.832245032656, 5612.270404847343, 5482.671039737628, 5653.123765816305, 5668.319801623749, 5691.4877661010705, 5733.88532229353, 5496.6701997880255, 5562.054450743383, 5573.359063707726, 5582.748776305076, 5582.888342233214, 5538.972305138448, 5583.0, 5654.095344744904, 5658.603897727202, 5731.226284451629, 4359.629431498295, 4371.912561748747, 4376.912461750747, 4382.496012958487, 4407.272799987966, 3830.4637350770913, 3850.614938506127, 3856.749311294757, 3871.1483473636317, 3891.630295121959, 5432.48391402824, 5461.9453805461435, 5473.753681084281, 5515.227868098469, 5519.448055194448, 5590.049691552445, 5657.8019769307875, 5662.178984047372, 5665.093585026376, 5677.347105082886, 5293.047251494768, 5463.344398672185, 5474.124140137559, 5477.3427188737605, 5524.972375138099, 4897.3878265216845, 4937.679050861682, 4940.925886111711, 4966.379202599675, 4998.600111991032, 5897.9115313271195, 5945.851353716105, 5947.256592925884, 5950.434708702666, 5952.702364881825, 5529.917051244154, 5646.35066967304, 5679.204911312502, 5690.857728556819, 5696.430356964436, 5775.8556036099435, 5790.160426738184, 5816.592838501264, 5883.146943693226, 5894.970525147347, 5518.917216241679, 5546.417626149358, 5549.250851135206, 5554.638948468337, 5561.694106824163, 5591.692456914746, 5667.914981275202, 5674.886502269849, 5677.5457963362005, 5689.459501347365, 5451.56387488992, 5464.836054918359, 5478.479544443271, 5553.194786755978, 5574.386817450159, 5468.72656367188, 5509.531689806411, 5517.420670829505, 5518.255035570147, 5527.751251193787, 5486.753096110605, 5495.477929596682, 5508.807191748269, 5509.696966666872, 5553.72231388437, 5334.75993580282, 5515.338159420895, 5536.474034966672, 5565.220869078251, 5618.85952851182, 5398.46015398457, 5454.672719636835, 5472.835814925558, 5479.561635069105, 5491.423400543045], "value": 5227.888307003319, "unit": "score"}, {"name": "ext.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [560.2240896358545, 577.2351634084837, 589.0927970924776, 604.0637012630423, 623.906414037894, 42217.57782422175, 43385.13229735404, 43432.56567434325, 43449.131017379674, 43471.652834716515, 43900.12199756003, 44186.0, 44348.0, 44474.77762611191, 44718.776406118006, 8895.911040889589, 9011.864822027675, 9025.638974441015, 9027.684031058914, 9036.954815225947, 8823.77940551485, 8860.24687901529, 8932.955335223314, 8933.0, 8948.105189481032, 8940.552972351357, 8992.325575581857, 8997.460152390844, 9002.054784247657, 9024.954875225614, 8946.552672366388, 8969.551522423853, 8978.147076027766, 8979.326550508738, 8990.05604411534, 8795.824083518357, 8905.465672059698, 8915.108489151098, 8946.59740311681, 8970.147835955573, 41469.0, 41774.0, 41808.58191418077, 41872.79063604693, 42094.36858447126, 3378.8817391391185, 3419.384510788057, 3460.757746957714, 3468.7051600613977, 3893.299206142893, 32451.350972980643, 32639.347213055607, 32920.506192407134, 34088.0, 34953.47569786455, 4273.67947403946, 4397.252467080572, 4430.357598148283, 4476.440444944382, 4480.126375356806, 350790.0, 351433.0, 354251.0, 354958.0, 355890.99999999744, 59170.70414647985, 59552.70223648854, 59800.0, 60055.699721501114, 60144.699276504216, 36164.638353616654, 36648.0, 36985.26029479395, 57626.7118664404, 57923.13115303274, 14776.852231477762, 14799.92600036993, 14804.0, 14816.481423150353, 14886.851131488764, 11271.549138034386, 11290.661280161608, 11398.259113157617, 11401.828972565418, 11403.828942565868, 18949.62100757977, 18955.0, 19002.0, 19122.904385477985, 19195.712064319046, 6973.58158510491, 7258.129024516986, 7281.963590182121, 7434.888476672854, 7458.4033277337685, 934.4486752815872, 989.2877128467492, 995.4077323992213, 1020.8264595018865, 1113.504490501735, 31603.20991975173, 33192.38376617874, 33219.3356132876, 33340.333193335995, 33363.83318083394, 1097.5829184909683, 1098.1544210957518, 1101.2951710905027, 1126.414264582429, 1137.8862113788555, 16961.15194240283, 17431.912840435718, 17527.29890804379, 17592.560185995197, 17603.911980440014, 572576.0, 574455.0, 578310.0, 579421.0, 579476.0, 59308.0, 59428.70285648544, 59450.0, 59949.0, 60119.699401502716, 1284.05621867927, 1333.8399392073013, 1360.0955364682573, 1360.9659758506314, 1364.4542183126828, 30854.53718194184, 33035.0, 33246.0, 33270.16824579405, 33584.32831343311, 50842.0, 52081.218781719064, 52109.47890521046, 52125.0, 52186.0, 475427.0, 481310.0, 482445.0, 482796.0, 483554.0, 29227.0, 29237.269068273465, 29414.558781617863, 29603.259918502208, 29637.25906852346, 48037.279440809114, 48816.267755982975, 49035.0, 49520.0, 49922.75038624783, 41441.58558414377, 41921.580784192985, 41926.37110443407, 42230.366544501245, 43024.354634681134, 41689.79155104205, 41921.58078419177, 42278.788606056776, 42336.78831605822, 42663.0, 42369.788151059045, 42582.0, 43357.78321108374, 43571.78214108909, 45655.08689826119, 32681.836590816893, 38320.0, 38920.41619375655, 39045.80477097596, 39080.609193907694, 29405.26486837846, 29433.0, 29437.55843662304, 29713.702862971957, 29730.702692972794], "value": 20182.011275593235, "unit": "score"}, {"name": "jquery.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [385.8572328238554, 387.46336324190986, 401.56831406238297, 404.1371671481387, 418.1532396896285, 18377.724334135, 19942.70085948712, 19988.90005549974, 20101.497462563406, 20312.492187695316, 17371.305147794104, 18076.096195190254, 18137.727934081, 18221.36225232117, 18508.814911850877, 5268.762905669245, 5384.300040994665, 5719.199312096289, 5915.1718759373725, 5991.460768530831, 5829.679367634779, 5886.264216972879, 5905.143754155645, 5918.260217472816, 5921.526277897758, 5316.362036555619, 5519.0, 5574.721263936807, 5637.0, 5916.201312822757, 5406.02691515527, 5467.0, 5487.725613719298, 5507.449255074481, 5553.944460555384, 5579.497845193911, 5723.828285151452, 5729.684867332295, 5734.942650573525, 5745.971270143665, 14674.926625366805, 23332.65001024986, 23718.0, 23735.762642373702, 24165.637515437284, 2304.481491664379, 2307.787544880525, 2953.7489313408387, 2954.1580649514785, 2959.9112026639236, 10030.348027378197, 10108.595656173744, 10244.385336879812, 10294.382337059726, 11298.548058077668, 1865.8134186581233, 1909.2076788132908, 1927.026851440028, 1944.1737261663736, 2002.499375156211, 76937.23062769357, 80576.99999999942, 84588.0, 88357.0, 90245.0, 10832.78334433307, 10930.63367079115, 11037.889621103686, 11055.899379117942, 11201.383923884265, 15714.764278535831, 15733.606659833596, 15745.212739362985, 15769.132697701736, 15777.132257725936, 7684.615769211517, 7858.567778772108, 7892.881606775903, 8057.194280572013, 8114.715984940617, 7473.738419155304, 7481.139668938033, 7558.0, 7763.650635721406, 7772.0, 4658.161530924398, 4702.52974702527, 4752.1921273383605, 4845.2732090186755, 4854.199057155601, 1964.528513156832, 1974.575466274729, 2029.8173164415273, 2044.2947183221765, 2074.346580827035, 929.3540989012706, 1036.3522798251092, 1054.1365893998563, 1058.9364638121738, 1072.780080083581, 18610.81389186118, 20205.797942020392, 20264.18943242254, 20360.79639203589, 20533.48666283325, 983.955721992512, 1002.4135880509838, 1004.2668851738272, 1010.3634710132717, 1018.7554986803113, 10686.305390149615, 11232.3260604364, 11243.94378028121, 11262.493187806569, 11330.490127944262, 467000.0, 467687.66156169004, 477250.0, 525447.0, 528274.0, 95619.52190239004, 96758.51620741992, 97964.51017744865, 98079.50960245154, 98663.0, 942.3968660057569, 988.5008070924138, 990.1237404896574, 990.3711143423834, 997.0627610046533, 16905.408310709066, 16919.23863426124, 17218.913905430392, 17788.110594470483, 18126.81873181304, 36766.0, 39913.0, 42596.0, 43899.561004390824, 44056.339154912064, 60153.69923150356, 62033.0, 62871.6856415715, 64367.67816160889, 66395.00407493796, 7372.889406658797, 7831.647575859214, 7940.801479963047, 8124.146964568635, 8342.79029540701, 12450.0, 13402.195868247936, 13639.863601364257, 13658.521951731642, 13807.378667959765, 11499.425028748696, 11530.82703759461, 11620.418979051183, 11627.941860290644, 12091.39543022863, 11243.156763242952, 11320.943345296888, 11333.433328333715, 11406.600768973047, 11491.195616307112, 11552.42237888119, 11571.710707232387, 11592.88407115918, 11937.761244774882, 12243.571474998333, 7535.171131175457, 7576.696932122653, 7692.461527693232, 7899.960500197462, 8007.959960200162, 10501.31741436804, 11780.234284771463, 11913.702157446132, 11916.880831191576, 11956.163068585463], "value": 9255.680804085625, "unit": "score"}, {"name": "mootools.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [1471.6762312291296, 1492.47763282851, 1611.30713793069, 1750.4311098892863, 1756.6223261998668, 7804.531728096318, 8444.66221351146, 8818.691345802898, 9104.36269461138, 9113.0, 8919.286457083434, 9198.862017069749, 9227.0, 9230.769230769234, 9247.07529247075, 2366.7633236676324, 2426.7694569015916, 2428.6357046443086, 2428.86641234732, 2432.598621227495, 2375.7267914189915, 2378.8096952243864, 2426.2478631624253, 2445.535348283829, 2446.694163229596, 2386.653935179398, 2430.793382562484, 2432.5499782540196, 2443.315871555967, 2450.4486490539666, 2376.310869847742, 2387.0451819272257, 2390.103711108334, 2407.9157229496973, 2430.2344761400277, 2358.9410264743346, 2360.5514952159033, 2367.597508423572, 2375.7267914189742, 2377.750336214707, 9196.448213107167, 9299.070092990714, 9304.953475232649, 9336.206422454099, 9340.486273254968, 5281.656692315026, 5421.756020979065, 5427.375851777057, 5454.61817672763, 5457.972710136424, 3283.589551306087, 3295.24209431832, 3322.9833850830832, 3350.3299340131825, 3359.378514974713, 1040.1834559870465, 1069.0859315285475, 1071.844582535528, 1075.5267682219876, 1081.416035340915, 12953.639867813838, 12995.895348895356, 13004.349782510932, 13030.218186908722, 13037.86962130376, 4550.385697930737, 4615.446146462446, 4794.328793968847, 4812.109759694397, 4834.081524510402, 10684.839727404094, 10747.957888001254, 10762.0, 10798.0, 10820.35077895313, 5414.214938833847, 5440.238366628675, 5444.774925641778, 5465.9180112298345, 5466.753996070186, 4358.36803663467, 4855.465898751135, 4948.653594248368, 4983.277424773388, 5013.323201367842, 4136.896577585524, 4148.798940138763, 4186.665066794649, 4225.72532785368, 4245.426867372865, 1295.9352032398342, 1299.2724074518112, 1312.1667740984544, 1346.8316460442445, 1353.15427857589, 959.2661613865398, 988.2044953812107, 998.0867506231862, 1010.9595616175418, 1012.3976234140674, 6092.939070609325, 6198.783042593487, 6312.873742525124, 6338.746450141943, 6434.903476447857, 957.7557722780786, 966.7341481092615, 994.8010397920444, 1027.50679673757, 1055.8099542082346, 4406.294992801137, 4447.266201076851, 4483.2602620567895, 4550.590446859798, 4659.673822832437, 11377.089832813355, 11615.709607259718, 11687.123465740104, 11692.824607630722, 11693.941530292293, 10844.620438284623, 11313.773724525628, 11597.362145081932, 11612.0, 11671.649850504498, 8469.153084691605, 8695.173958473935, 8700.912990870136, 8708.433951793113, 8738.650453981769, 6263.123162757309, 6315.179026726496, 6465.547411681137, 6489.091527186103, 6622.602643841385, 10294.227932904912, 10364.844527332247, 10372.948135259276, 10468.110210632181, 10472.790544189225, 10247.897521024992, 10496.370217786956, 10625.521851516545, 10814.837777433188, 10898.12814974816, 7321.0, 7873.724419645285, 8005.279524842792, 8218.260356567938, 8403.873941890753, 8996.685116020908, 9072.546372681472, 9083.772905677146, 9110.316726245426, 9136.31477639193, 7959.920400795918, 8117.1071182168735, 8244.051934027664, 8291.253787159185, 8407.033191183093, 7536.472446928662, 7789.805254868674, 7911.683532658629, 7984.720534781255, 8076.353891688768, 7168.247334029852, 7294.489385742947, 7524.247575242651, 7532.359749421142, 7543.35881450061, 5504.394516603251, 5544.500994910478, 5580.21876937221, 5581.441855814386, 5678.602497825278, 5276.894462110813, 5378.865528361822, 5445.891082178414, 5462.481064298885, 5536.003519366553], "value": 4832.116443508414, "unit": "score"}, {"name": "prototype.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [293.9397423528177, 298.50299251745844, 301.92300963254365, 309.30715197956584, 310.8787572846589, 5502.147167189087, 5524.226608274845, 5574.275344205248, 5578.163275508676, 5600.215969764231, 5503.972480137603, 5528.087865502187, 5539.612227144102, 5553.250311207986, 5586.273784408021, 4110.753354798714, 4124.566920473352, 4170.249355116078, 4206.592659945454, 4218.725782824122, 4194.727342722713, 4203.390508376284, 4205.0748835256345, 4217.388478670591, 4225.830966761326, 4174.645155161815, 4190.769507677077, 4193.412922190896, 4214.6838987075935, 4219.649712092132, 3982.880513584583, 4157.563455837124, 4199.790010499493, 4204.5585213552595, 4212.136512015029, 3622.1487950331652, 3627.0, 3635.9636403636155, 3648.4892115103908, 3656.469811877263, 5321.7605207765355, 5339.813106541253, 5350.571954243651, 5352.57179425645, 5363.1039238811, 4516.725374103781, 4716.8349107781405, 4737.73942433166, 4743.505795674351, 4772.665913386064, 5695.800646977377, 5698.943010569883, 5707.944030354356, 5778.971105144489, 5785.871755007775, 3981.0843505993785, 3998.3602623580377, 4000.4999375078114, 4007.5591684914634, 4022.1352409231863, 5872.295324561037, 5966.284045914518, 6030.155778191057, 6035.366286539938, 6044.486218671462, 4075.2460794753065, 4095.488063992001, 4104.835806567764, 4105.337338377962, 4106.650934670586, 4137.8965525861495, 4146.771927544014, 4148.543660197376, 4149.875503734893, 4156.649089046072, 4724.645651576146, 4791.377120974321, 4808.855734327975, 4829.227323628273, 4829.613630909519, 5733.397993210736, 5758.782868595621, 5768.855778605568, 5772.797952071657, 5785.421457854265, 1423.8220222472191, 1446.3491428857055, 1447.1823419767798, 1451.7241724072392, 1455.3887367305756, 851.923326900582, 903.5527413930147, 906.7642412972675, 909.2589539525266, 926.8748718922859, 5483.150111732688, 5537.6709589698185, 5548.72256387179, 5560.555155587544, 5580.218769372291, 5833.445822646841, 5834.154047663065, 5843.795467158629, 5855.355910849803, 5933.881322373529, 5300.27036076421, 5602.271704678447, 5603.7478313475995, 5655.604107712503, 5670.659760414306, 3155.8224824870767, 3167.55654208411, 3170.8097514149226, 3179.9205019874225, 3186.5978969253456, 6068.877257707339, 6176.598521096114, 6230.906536401958, 6253.812385628438, 6268.749250030039, 6026.54800889935, 6048.546359023091, 6064.75672487139, 6090.23872015998, 6100.298465676416, 6116.26604807426, 6170.796694644591, 6202.627842329474, 6251.531135164881, 6290.050084473828, 5664.716764161693, 5812.912806307993, 5830.47525722687, 5832.37114012495, 5960.225170727951, 5905.911411328748, 5918.585699001201, 5940.0, 5960.642361458326, 5962.135490353961, 5907.793227237026, 6179.16581261524, 6207.193064901534, 6213.5339849512375, 6256.655883926428, 4109.794510274534, 4142.91714165709, 4145.316022856195, 4146.958530414658, 4150.481189851269, 5964.777220669665, 5971.313298970674, 5973.283206015306, 5983.431574000463, 5993.580449368676, 5735.36910939788, 5778.422157784356, 5805.883882322245, 5836.824895253149, 5840.795572154954, 5768.105943578752, 5808.767649293981, 5823.1847541343395, 5831.329397119385, 5835.737391817293, 5223.3209682741, 5801.477866991991, 5830.679312637845, 5833.762261944661, 5866.592017915584, 5753.741081651252, 5814.505767009851, 5816.760547189448, 5843.561732870136, 5864.035548091437, 5695.829125126253, 5714.771409143587, 5715.799682066812, 5725.341585717696, 5731.455511726379], "value": 4352.714290363909, "unit": "score"}, {"name": "yui.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [722.3101937649545, 738.8152961759561, 772.9989663385915, 796.6335485676589, 813.7571776470767, 16682.83317166828, 17535.2109155088, 17538.29846806126, 17589.120543972815, 17602.0, 14850.628734281649, 14863.92568037161, 14943.626409339771, 14973.700525989474, 14979.625509362271, 648.6432462145801, 750.1373420566365, 761.958092304923, 762.6072572625103, 782.1826191629747, 791.7189397763798, 795.2167115391335, 797.0634504457269, 799.3684988858795, 800.1878093734864, 862.965481380744, 865.4028720183054, 867.7960679240374, 868.5440143924427, 870.4907629037021, 852.2244757270885, 855.0295414704356, 857.1728282207699, 859.1194026123211, 862.4178679391417, 629.2354788931425, 630.6342321453592, 631.1952260867384, 632.0582332324803, 633.1389310537666, 15605.297761600756, 15607.921960390238, 15733.842661573466, 15777.368905243777, 15794.605134871605, 14375.712485750331, 14447.566573002827, 14639.0, 15612.0, 15999.600009999727, 12589.874101258962, 12699.365031748375, 12723.872761272361, 12831.679208019874, 13037.282949437777, 3870.4581358609817, 3941.408788681692, 3966.087799806032, 4011.237864805707, 4063.97968010161, 89819.55090224573, 90567.0, 90965.54517227372, 92984.53507732485, 94908.0, 11793.174477786644, 11935.641930742091, 11955.581554645545, 12046.698832529082, 12129.514819407124, 23895.283141505784, 23931.641025384633, 23943.922523486486, 24103.276901692978, 24104.87947560251, 8463.407561470762, 8582.78543036429, 8639.524826134497, 8745.169208925143, 8837.734867953972, 4691.554302341272, 4733.5503127202865, 4742.976285118552, 4763.666543341933, 4820.662553621283, 3398.456247000468, 3515.8593656253465, 3523.3657941570764, 3530.5233793437556, 3534.7879127252445, 563.6449037106596, 565.5758181363977, 571.9170720245542, 580.7531798985415, 587.4096532984323, 731.7438896386328, 733.1678544851632, 750.557171268954, 754.9245075492516, 804.8671969125146, 9580.281478888972, 10431.791364172674, 10600.840987385196, 10626.309289896131, 10746.946265268623, 671.7648822912039, 691.778630838127, 760.8288135169543, 762.1121393576532, 773.05301006268, 4804.711717296974, 4811.566958973709, 5150.510701483353, 5170.069387510209, 5178.844634660966, 123776.38111809384, 128972.35513822558, 130121.34939325243, 130980.0, 131576.0, 109108.4544577272, 109425.0, 111358.44320778507, 112692.0, 115320.42339788248, 95277.0, 97666.51166744121, 98397.0, 103595.0, 104017.47991259996, 9505.809883802147, 10015.799684006424, 10035.849462257926, 10077.294589378966, 10164.695059148238, 56664.716676416356, 57429.71285143548, 57639.711801442405, 58668.413315866295, 60636.393636063076, 76292.85560716705, 78280.2171978273, 83210.5839470823, 85609.57195213984, 86788.0, 11132.721681958015, 11372.488238029475, 11847.822282665938, 12309.26144431337, 12428.56500022495, 15352.616184595028, 15399.0, 15860.0, 16034.35862565531, 16241.756373654642, 14703.264836758333, 14887.404503819726, 15260.923695381452, 15622.916397145971, 15644.530664080095, 13554.728905422033, 13712.245826479639, 13947.30263486842, 14374.568762937128, 14698.338574763948, 14595.92702036483, 14692.485762998243, 14794.63013424673, 14967.625809354853, 15141.167235802137, 11265.65228236468, 11368.0, 11661.300321980709, 12009.459574319351, 12032.59348130395, 10683.839742403714, 11183.440827958408, 11950.521979120738, 12449.813252801034, 12605.0], "value": 7927.217342581658, "unit": "score"}]}, {"extraOptions": ["e10s"], "name": "kraken", "lowerIsBetter": true, "alertThreshold": 2.0, "value": 1526.1, "subtests": [{"name": "ai-astar", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [102.0, 113.0, 107.0, 112.0, 113.0, 114.0, 115.0, 112.0, 112.0, 114.0], "value": 111.4, "unit": "score"}, {"name": "audio-beat-detection", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [147.0, 117.0, 142.0, 172.0, 124.0, 147.0, 149.0, 120.0, 182.0, 118.0], "value": 141.8, "unit": "score"}, {"name": "audio-dft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [162.0, 162.0, 163.0, 162.0, 162.0, 165.0, 177.0, 162.0, 165.0, 163.0], "value": 164.3, "unit": "score"}, {"name": "audio-fft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [75.0, 75.0, 76.0, 173.0, 75.0, 75.0, 79.0, 75.0, 169.0, 76.0], "value": 94.8, "unit": "score"}, {"name": "audio-oscillator", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [85.0, 84.0, 151.0, 85.0, 84.0, 86.0, 147.0, 83.0, 83.0, 143.0], "value": 103.1, "unit": "score"}, {"name": "imaging-gaussian-blur", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [117.0, 117.0, 118.0, 122.0, 118.0, 118.0, 118.0, 118.0, 118.0, 118.0], "value": 118.2, "unit": "score"}, {"name": "imaging-darkroom", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [148.0, 148.0, 148.0, 147.0, 150.0, 147.0, 148.0, 146.0, 147.0, 147.0], "value": 147.6, "unit": "score"}, {"name": "imaging-desaturate", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [95.0, 97.0, 96.0, 95.0, 95.0, 98.0, 96.0, 97.0, 96.0, 95.0], "value": 96.0, "unit": "score"}, {"name": "json-parse-financial", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [52.0, 51.0, 51.0, 51.0, 51.0, 54.0, 60.0, 51.0, 51.0, 51.0], "value": 52.3, "unit": "score"}, {"name": "json-stringify-tinderbox", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [60.0, 61.0, 61.0, 61.0, 61.0, 60.0, 61.0, 62.0, 61.0, 62.0], "value": 61.0, "unit": "score"}, {"name": "stanford-crypto-aes", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [78.0, 76.0, 77.0, 78.0, 77.0, 77.0, 81.0, 75.0, 81.0, 76.0], "value": 77.6, "unit": "score"}, {"name": "stanford-crypto-ccm", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [131.0, 124.0, 132.0, 123.0, 130.0, 123.0, 126.0, 126.0, 139.0, 134.0], "value": 128.8, "unit": "score"}, {"name": "stanford-crypto-pbkdf2", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [173.0, 169.0, 161.0, 164.0, 166.0, 159.0, 162.0, 160.0, 159.0, 160.0], "value": 163.3, "unit": "score"}, {"name": "stanford-crypto-sha256-iterative", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [72.0, 75.0, 65.0, 65.0, 64.0, 65.0, 64.0, 64.0, 63.0, 62.0], "value": 65.9, "unit": "score"}]}]} 10:22:04 INFO - Return code: 0 10:22:04 INFO - Validating PERFHERDER_DATA against /builds/slave/test/scripts/external_tools/performance-artifact-schema.json 10:22:04 ERROR - # TBPL SUCCESS # 10:22:04 INFO - Running post-action listener: _resource_record_post_action 10:22:04 INFO - [mozharness: 2016-08-10 17:22:04.108881Z] Finished run-tests step (success) 10:22:04 INFO - Running post-run listener: _resource_record_post_run 10:22:04 INFO - Total resource usage - Wall time: 1192s; CPU: 13.0%; Read bytes: 4096; Write bytes: 545062912; Read time: 12; Write time: 645604 10:22:04 INFO - TinderboxPrint: CPU usage
13.3% 10:22:04 INFO - TinderboxPrint: I/O read bytes / time
4,096 / 12 10:22:04 INFO - TinderboxPrint: I/O write bytes / time
545,062,912 / 645,604 10:22:04 INFO - TinderboxPrint: CPU idle
8,241.6 (86.6%) 10:22:04 INFO - TinderboxPrint: CPU user
1,211.3 (12.7%) 10:22:04 INFO - TinderboxPrint: Swap in / out
0 / 0 10:22:04 INFO - install - Wall time: 17s; CPU: 14.0%; Read bytes: 0; Write bytes: 251633664; Read time: 0; Write time: 377952 10:22:04 INFO - run-tests - Wall time: 1176s; CPU: 13.0%; Read bytes: 0; Write bytes: 292954112; Read time: 0; Write time: 267652 10:22:04 INFO - Running post-run listener: _upload_blobber_files 10:22:04 INFO - Blob upload gear active. 10:22:04 INFO - Preparing to upload files from /builds/slave/test/build/blobber_upload_dir. 10:22:04 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 10:22:04 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/venv/bin/blobberc.py', '-u', 'https://blobupload.elasticbeanstalk.com', '-a', '/builds/slave/test/oauth.txt', '-b', 'Fx-Team', '-d', '/builds/slave/test/build/blobber_upload_dir', '--output-manifest', '/builds/slave/test/build/uploaded_files.json'] 10:22:04 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/venv/bin/blobberc.py -u https://blobupload.elasticbeanstalk.com -a /builds/slave/test/oauth.txt -b Fx-Team -d /builds/slave/test/build/blobber_upload_dir --output-manifest /builds/slave/test/build/uploaded_files.json 10:22:05 INFO - (blobuploader) - INFO - Open directory for files ... 10:22:05 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log ... 10:22:05 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 10:22:05 INFO - (blobuploader) - INFO - Uploading, attempt #1. 10:22:05 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_raw.log: uploaded 10:22:06 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 10:22:06 INFO - (blobuploader) - INFO - Done attempting. 10:22:06 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/resource-usage.json ... 10:22:06 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 10:22:06 INFO - (blobuploader) - INFO - Uploading, attempt #1. 10:22:09 INFO - (blobuploader) - INFO - TinderboxPrint: resource-usage.json: uploaded 10:22:09 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 10:22:09 INFO - (blobuploader) - INFO - Done attempting. 10:22:09 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log ... 10:22:09 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 10:22:09 INFO - (blobuploader) - INFO - Uploading, attempt #1. 10:22:09 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_errorsummary.log: uploaded 10:22:09 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 10:22:09 INFO - (blobuploader) - INFO - Done attempting. 10:22:09 INFO - (blobuploader) - INFO - Iteration through files over. 10:22:10 INFO - Return code: 0 10:22:10 INFO - rmtree: /builds/slave/test/build/uploaded_files.json 10:22:10 INFO - retry: Calling remove with args: ('/builds/slave/test/build/uploaded_files.json',), kwargs: {}, attempt #1 10:22:10 INFO - Setting buildbot property blobber_files to {"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/ddebdd0da571be570d6ef892d8b92c359cb96e67417dfb4ee233d3ec4856b6714d94f0b99a9b1b44b16eff7c4410245d361ef62eaa8dde3058dbd426870496e4", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/26c5e087a6fd61c9b13d64970fc3d54552debc2f8131623aacc46dd8488cf7434d440c05e6009aeb1b101dc015fb05ca48bec717252bee6911d59ab75cd60db4", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/2099e5c762356305c34f7eb0da5a05368cd45cae87dae20b67695cd33b36864cf7ac20fcd550278bf4cea8cdad37d5405585748ee35b7bb96f5a26867f598193"} 10:22:10 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test/properties/blobber_files 10:22:10 INFO - Writing to file /builds/slave/test/properties/blobber_files 10:22:10 INFO - Contents: 10:22:10 INFO - blobber_files:{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/ddebdd0da571be570d6ef892d8b92c359cb96e67417dfb4ee233d3ec4856b6714d94f0b99a9b1b44b16eff7c4410245d361ef62eaa8dde3058dbd426870496e4", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/26c5e087a6fd61c9b13d64970fc3d54552debc2f8131623aacc46dd8488cf7434d440c05e6009aeb1b101dc015fb05ca48bec717252bee6911d59ab75cd60db4", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/2099e5c762356305c34f7eb0da5a05368cd45cae87dae20b67695cd33b36864cf7ac20fcd550278bf4cea8cdad37d5405585748ee35b7bb96f5a26867f598193"} 10:22:10 INFO - Running post-run listener: copy_logs_to_upload_dir 10:22:10 INFO - Copying logs to upload dir... 10:22:10 INFO - mkdir: /builds/slave/test/build/upload/logs 10:22:10 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1230.302074 ========= master_lag: 0.02 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 30 secs) (at 2016-08-10 10:22:09.602316) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-08-10 10:22:09.605871) ========= 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=8783db0840cc980e80bb0bd400000236-1470848496.927111-1403802561 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False blobber_files:{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/ddebdd0da571be570d6ef892d8b92c359cb96e67417dfb4ee233d3ec4856b6714d94f0b99a9b1b44b16eff7c4410245d361ef62eaa8dde3058dbd426870496e4", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/26c5e087a6fd61c9b13d64970fc3d54552debc2f8131623aacc46dd8488cf7434d440c05e6009aeb1b101dc015fb05ca48bec717252bee6911d59ab75cd60db4", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/2099e5c762356305c34f7eb0da5a05368cd45cae87dae20b67695cd33b36864cf7ac20fcd550278bf4cea8cdad37d5405585748ee35b7bb96f5a26867f598193"} build_url:https://queue.taskcluster.net/v1/task/WONP0w2iSROXl5SW7huafg/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.tar.bz2 program finished with exit code 0 elapsedTime=0.011237 build_url: 'https://queue.taskcluster.net/v1/task/WONP0w2iSROXl5SW7huafg/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.tar.bz2' blobber_files: '{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/ddebdd0da571be570d6ef892d8b92c359cb96e67417dfb4ee233d3ec4856b6714d94f0b99a9b1b44b16eff7c4410245d361ef62eaa8dde3058dbd426870496e4", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/26c5e087a6fd61c9b13d64970fc3d54552debc2f8131623aacc46dd8488cf7434d440c05e6009aeb1b101dc015fb05ca48bec717252bee6911d59ab75cd60db4", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/2099e5c762356305c34f7eb0da5a05368cd45cae87dae20b67695cd33b36864cf7ac20fcd550278bf4cea8cdad37d5405585748ee35b7bb96f5a26867f598193"}' ========= master_lag: 0.02 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-08-10 10:22:09.639509) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-08-10 10:22:09.639822) ========= 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=8783db0840cc980e80bb0bd400000236-1470848496.927111-1403802561 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004448 ========= master_lag: 0.08 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-08-10 10:22:09.727054) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2016-08-10 10:22:09.727389) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2016-08-10 10:22:09.727669) ========= ========= Total master_lag: 0.19 =========