builder: mozilla-inbound_ubuntu64_hw_test-dromaeojs-pgo slave: talos-linux64-ix-066 starttime: 1467740989.94 results: success (0) buildid: 20160704013020 builduid: 02dd44b6e432459984e9a259e0a97445 revision: 55eb13faa8e016818d8fd96e6e30e3fb89dd0af7 ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2016-07-05 10:49:49.940602) ========= master: http://buildbot-master104.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2016-07-05 10:49:49.941355) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-07-05 10:49:49.941772) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-07-05 10:49:49.957177) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-07-05 10:49:49.957621) ========= 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=82c74bd3bc9a11c5833d2010000001e6-1467740990.321698-195106195 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2016-07-05 10:49:51-- https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py Resolving hg.mozilla.org (hg.mozilla.org)... 63.245.215.102, 63.245.215.25 Connecting to hg.mozilla.org (hg.mozilla.org)|63.245.215.102|:443... connected. HTTP request sent, awaiting response... 200 Script output follows Length: 12141 (12K) [text/x-python] Saving to: `archiver_client.py' 0K .......... . 100% 221M=0s 2016-07-05 10:49:51 (221 MB/s) - `archiver_client.py' saved [12141/12141] program finished with exit code 0 elapsedTime=0.109043 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-07-05 10:49:50.081271) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-07-05 10:49:50.081717) ========= 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=82c74bd3bc9a11c5833d2010000001e6-1467740990.321698-195106195 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.020576 ========= master_lag: 0.03 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-07-05 10:49:50.132779) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-07-05 10:49:50.133186) ========= bash -c 'python archiver_client.py mozharness --repo integration/mozilla-inbound --rev 55eb13faa8e016818d8fd96e6e30e3fb89dd0af7 --destination scripts --debug' in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', u'python archiver_client.py mozharness --repo integration/mozilla-inbound --rev 55eb13faa8e016818d8fd96e6e30e3fb89dd0af7 --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=82c74bd3bc9a11c5833d2010000001e6-1467740990.321698-195106195 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2016-07-05 10:49:51,667 truncating revision to first 12 chars 2016-07-05 10:49:51,668 Setting DEBUG logging. 2016-07-05 10:49:51,668 attempt 1/10 2016-07-05 10:49:51,668 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/integration/mozilla-inbound/55eb13faa8e0?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2016-07-05 10:49:52,161 unpacking tar archive at: mozilla-inbound-55eb13faa8e0/testing/mozharness/ program finished with exit code 0 elapsedTime=0.836081 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-07-05 10:49:50.985050) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-07-05 10:49:50.985468) ========= script_repo_revision: 55eb13faa8e016818d8fd96e6e30e3fb89dd0af7 ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-07-05 10:49:50.986124) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-07-05 10:49:50.986602) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-07-05 10:49:50.997275) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 30 secs) (at 2016-07-05 10:49:50.997729) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs --add-option --webServer,localhost --branch-name Mozilla-Inbound --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Mozilla-Inbound in dir /builds/slave/test/. (timeout 3600 secs) (maxTime 7200 secs) watching logfiles {} argv: ['/tools/buildbot/bin/python', 'scripts/scripts/talos_script.py', '--suite', 'dromaeojs', '--add-option', '--webServer,localhost', '--branch-name', 'Mozilla-Inbound', '--cfg', 'talos/linux_config.py', '--download-symbols', 'ondemand', '--use-talos-json', '--blob-upload-branch', 'Mozilla-Inbound'] 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=82c74bd3bc9a11c5833d2010000001e6-1467740990.321698-195106195 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 10:49:52 INFO - MultiFileLogger online at 20160705 10:49:52 in /builds/slave/test 10:49:52 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs --add-option --webServer,localhost --branch-name Mozilla-Inbound --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Mozilla-Inbound 10:49:52 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 10:49:52 INFO - {'append_to_log': False, 10:49:52 INFO - 'base_work_dir': '/builds/slave/test', 10:49:52 INFO - 'blob_upload_branch': 'Mozilla-Inbound', 10:49:52 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 10:49:52 INFO - 'branch': 'Mozilla-Inbound', 10:49:52 INFO - 'buildbot_json_path': 'buildprops.json', 10:49:52 INFO - 'config_files': ('talos/linux_config.py',), 10:49:52 INFO - 'default_actions': ('clobber', 10:49:52 INFO - 'read-buildbot-config', 10:49:52 INFO - 'download-and-extract', 10:49:52 INFO - 'populate-webroot', 10:49:52 INFO - 'create-virtualenv', 10:49:52 INFO - 'install', 10:49:52 INFO - 'run-tests'), 10:49:52 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 10:49:52 INFO - 'download_minidump_stackwalk': True, 10:49:52 INFO - 'download_symbols': 'ondemand', 10:49:52 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 10:49:52 INFO - 'tooltool.py': '/tools/tooltool.py', 10:49:52 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 10:49:52 INFO - '/tools/misc-python/virtualenv.py')}, 10:49:52 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 10:49:52 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 10:49:52 INFO - 'installer_path': 'installer.exe', 10:49:52 INFO - 'log_level': 'info', 10:49:52 INFO - 'log_name': 'talos', 10:49:52 INFO - 'log_to_console': True, 10:49:52 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 10:49:52 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 10:49:52 INFO - 'opt_config_files': (), 10:49:52 INFO - 'pip_index': False, 10:49:52 INFO - 'sps_profile': False, 10:49:52 INFO - 'sps_profile_interval': 0, 10:49:52 INFO - 'suite': 'dromaeojs', 10:49:52 INFO - 'system_bits': '32', 10:49:52 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 10:49:52 INFO - 'title': 'talos-linux64-ix-066', 10:49:52 INFO - 'tooltool_cache': '/builds/tooltool_cache', 10:49:52 INFO - 'use_talos_json': True, 10:49:52 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 10:49:52 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 10:49:52 INFO - 'work_dir': 'build'} 10:49:52 INFO - ##### 10:49:52 INFO - ##### Running clobber step. 10:49:52 INFO - ##### 10:49:52 INFO - Running pre-action listener: _resource_record_pre_action 10:49:52 INFO - Running main action method: clobber 10:49:52 INFO - rmtree: /builds/slave/test/build 10:49:52 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 10:49:53 INFO - Running post-action listener: _resource_record_post_action 10:49:53 INFO - ##### 10:49:53 INFO - ##### Finished clobber step (success) 10:49:53 INFO - ##### 10:49:53 INFO - ##### 10:49:53 INFO - ##### Running read-buildbot-config step. 10:49:53 INFO - ##### 10:49:53 INFO - Running pre-action listener: _resource_record_pre_action 10:49:53 INFO - Running main action method: read_buildbot_config 10:49:53 INFO - Using buildbot properties: 10:49:53 INFO - { 10:49:53 INFO - "project": "", 10:49:53 INFO - "product": "firefox", 10:49:53 INFO - "script_repo_revision": "production", 10:49:53 INFO - "builddir": "mozilla-inbound_ubuntu64_hw_test-dromaeojs", 10:49:53 INFO - "repository": "", 10:49:53 INFO - "buildername": "Ubuntu HW 12.04 x64 mozilla-inbound pgo talos dromaeojs", 10:49:53 INFO - "buildid": "20160704013020", 10:49:53 INFO - "pgo_build": "True", 10:49:53 INFO - "basedir": "/builds/slave/test", 10:49:53 INFO - "buildnumber": 1205, 10:49:53 INFO - "slavename": "talos-linux64-ix-066", 10:49:53 INFO - "master": "http://buildbot-master104.bb.releng.scl3.mozilla.com:8201/", 10:49:53 INFO - "platform": "ubuntu64_hw", 10:49:53 INFO - "scheduler": "tests-mozilla-inbound-linux64-pgo-talos", 10:49:53 INFO - "branch": "mozilla-inbound", 10:49:53 INFO - "repo_path": "integration/mozilla-inbound", 10:49:53 INFO - "revision": "55eb13faa8e016818d8fd96e6e30e3fb89dd0af7", 10:49:53 INFO - "stage_platform": "linux64-pgo", 10:49:53 INFO - "builduid": "02dd44b6e432459984e9a259e0a97445", 10:49:53 INFO - "slavebuilddir": "test" 10:49:53 INFO - } 10:49:53 INFO - Found installer url https://queue.taskcluster.net/v1/task/RjvOvvIeT1-zobCVCBuK3w/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2. 10:49:53 INFO - Running post-action listener: _resource_record_post_action 10:49:53 INFO - ##### 10:49:53 INFO - ##### Finished read-buildbot-config step (success) 10:49:53 INFO - ##### 10:49:53 INFO - ##### 10:49:53 INFO - ##### Running download-and-extract step. 10:49:53 INFO - ##### 10:49:53 INFO - Running pre-action listener: _resource_record_pre_action 10:49:53 INFO - Running main action method: download_and_extract 10:49:53 INFO - mkdir: /builds/slave/test/build/tests 10:49:53 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 10:49:53 INFO - https://queue.taskcluster.net/v1/task/RjvOvvIeT1-zobCVCBuK3w/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.test_packages.json matches https://queue.taskcluster.net 10:49:53 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/RjvOvvIeT1-zobCVCBuK3w/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.test_packages.json 10:49:53 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/RjvOvvIeT1-zobCVCBuK3w/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.test_packages.json 10:49:53 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/RjvOvvIeT1-zobCVCBuK3w/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.test_packages.json to /builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.test_packages.json 10:49:53 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/RjvOvvIeT1-zobCVCBuK3w/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.test_packages.json', 'file_name': '/builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.test_packages.json'}, attempt #1 10:49:53 INFO - Downloaded 1361 bytes. 10:49:53 INFO - Reading from file /builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.test_packages.json 10:49:53 INFO - Using the following test package requirements: 10:49:53 INFO - {u'common': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip'], 10:49:53 INFO - u'cppunittest': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 10:49:53 INFO - u'firefox-50.0a1.en-US.linux-x86_64.cppunittest.tests.zip'], 10:49:53 INFO - u'gtest': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 10:49:53 INFO - u'firefox-50.0a1.en-US.linux-x86_64.gtest.tests.zip'], 10:49:53 INFO - u'jittest': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 10:49:53 INFO - u'jsshell-linux-x86_64.zip'], 10:49:53 INFO - u'mochitest': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 10:49:53 INFO - u'firefox-50.0a1.en-US.linux-x86_64.mochitest.tests.zip'], 10:49:53 INFO - u'mozbase': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip'], 10:49:53 INFO - u'reftest': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 10:49:53 INFO - u'firefox-50.0a1.en-US.linux-x86_64.reftest.tests.zip'], 10:49:53 INFO - u'talos': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 10:49:53 INFO - u'firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip'], 10:49:53 INFO - u'web-platform': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 10:49:53 INFO - u'firefox-50.0a1.en-US.linux-x86_64.web-platform.tests.zip'], 10:49:53 INFO - u'xpcshell': [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 10:49:53 INFO - u'firefox-50.0a1.en-US.linux-x86_64.xpcshell.tests.zip']} 10:49:53 INFO - Downloading packages: [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip'] for test suite category: common 10:49:53 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 10:49:53 INFO - https://queue.taskcluster.net/v1/task/RjvOvvIeT1-zobCVCBuK3w/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 10:49:53 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/RjvOvvIeT1-zobCVCBuK3w/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip 10:49:53 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/RjvOvvIeT1-zobCVCBuK3w/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip 10:49:53 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/RjvOvvIeT1-zobCVCBuK3w/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip to /builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip 10:49:53 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/RjvOvvIeT1-zobCVCBuK3w/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip'}, attempt #1 10:49:54 INFO - Downloaded 24276373 bytes. 10:49:54 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', '-d', '/builds/slave/test/build/tests'] 10:49:54 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip -d /builds/slave/test/build/tests 10:49:56 INFO - Return code: 0 10:49:56 INFO - Downloading packages: [u'firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', u'firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip'] for test suite category: talos 10:49:56 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 10:49:56 INFO - https://queue.taskcluster.net/v1/task/RjvOvvIeT1-zobCVCBuK3w/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip matches https://queue.taskcluster.net 10:49:56 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/RjvOvvIeT1-zobCVCBuK3w/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip 10:49:56 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/RjvOvvIeT1-zobCVCBuK3w/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip 10:49:56 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/RjvOvvIeT1-zobCVCBuK3w/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip to /builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip 10:49:56 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/RjvOvvIeT1-zobCVCBuK3w/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip'}, attempt #1 10:49:57 INFO - Downloaded 24276373 bytes. 10:49:57 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip', '-d', '/builds/slave/test/build/tests'] 10:49:57 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.common.tests.zip -d /builds/slave/test/build/tests 10:49:58 INFO - Return code: 0 10:49:58 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 10:49:58 INFO - https://queue.taskcluster.net/v1/task/RjvOvvIeT1-zobCVCBuK3w/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip matches https://queue.taskcluster.net 10:49:58 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/RjvOvvIeT1-zobCVCBuK3w/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip 10:49:58 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/RjvOvvIeT1-zobCVCBuK3w/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip 10:49:58 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/RjvOvvIeT1-zobCVCBuK3w/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip to /builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip 10:49:58 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/RjvOvvIeT1-zobCVCBuK3w/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip'}, attempt #1 10:49:59 INFO - Downloaded 14403333 bytes. 10:49:59 INFO - Running command: ['unzip', '-q', '-o', u'/builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip', '-d', '/builds/slave/test/build/tests'] 10:49:59 INFO - Copy/paste: unzip -q -o /builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.talos.tests.zip -d /builds/slave/test/build/tests 10:49:59 INFO - Return code: 0 10:49:59 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 10:49:59 INFO - https://queue.taskcluster.net/v1/task/RjvOvvIeT1-zobCVCBuK3w/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 matches https://queue.taskcluster.net 10:49:59 INFO - URL Candidate: http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/RjvOvvIeT1-zobCVCBuK3w/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 10:49:59 INFO - trying http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/RjvOvvIeT1-zobCVCBuK3w/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 10:49:59 INFO - Downloading http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/RjvOvvIeT1-zobCVCBuK3w/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 to /builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 10:49:59 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'http://queue.taskcluster.net.proxxy1.srv.releng.scl3.mozilla.com/v1/task/RjvOvvIeT1-zobCVCBuK3w/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2', 'file_name': '/builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2'}, attempt #1 10:50:01 INFO - Downloaded 60359123 bytes. 10:50:01 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/RjvOvvIeT1-zobCVCBuK3w/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 10:50:01 INFO - mkdir: /builds/slave/test/properties 10:50:01 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 10:50:01 INFO - Writing to file /builds/slave/test/properties/build_url 10:50:01 INFO - Contents: 10:50:01 INFO - build_url:https://queue.taskcluster.net/v1/task/RjvOvvIeT1-zobCVCBuK3w/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 10:50:02 INFO - Running post-action listener: _resource_record_post_action 10:50:02 INFO - Running post-action listener: set_extra_try_arguments 10:50:02 INFO - ##### 10:50:02 INFO - ##### Finished download-and-extract step (success) 10:50:02 INFO - ##### 10:50:02 INFO - ##### 10:50:02 INFO - ##### Running populate-webroot step. 10:50:02 INFO - ##### 10:50:02 INFO - Running pre-action listener: _resource_record_pre_action 10:50:02 INFO - Running main action method: populate_webroot 10:50:02 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 10:50:02 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 10:50:02 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 10:50:02 INFO - '--tppagecycles', 10:50:02 INFO - '7'], 10:50:02 INFO - 'tests': ['tsvgm']}}, 10:50:02 INFO - 'suites': {'chromez': {'talos_options': ['--disable-e10s'], 10:50:02 INFO - 'tests': ['tresize', 'tcanvasmark']}, 10:50:02 INFO - 'chromez-e10s': {'tests': ['tresize', 'tcanvasmark']}, 10:50:02 INFO - 'dromaeojs': {'talos_options': ['--disable-e10s'], 10:50:02 INFO - 'tests': ['dromaeo_css', 'kraken']}, 10:50:02 INFO - 'dromaeojs-e10s': {'tests': ['dromaeo_css', 'kraken']}, 10:50:02 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 10:50:02 INFO - 'talos_options': ['--disable-e10s'], 10:50:02 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 10:50:02 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 10:50:02 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 10:50:02 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 10:50:02 INFO - 'talos_options': ['--disable-e10s'], 10:50:02 INFO - 'tests': ['damp', 'tps']}, 10:50:02 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 10:50:02 INFO - 'tests': ['damp', 'tps']}, 10:50:02 INFO - 'g3': {'talos_options': ['--disable-e10s'], 10:50:02 INFO - 'tests': ['dromaeo_dom']}, 10:50:02 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 10:50:02 INFO - 'g4': {'talos_options': ['--disable-e10s'], 10:50:02 INFO - 'tests': ['basic_compositor_video']}, 10:50:02 INFO - 'g4-e10s': {'tests': ['basic_compositor_video']}, 10:50:02 INFO - 'other': {'talos_options': ['--disable-e10s'], 10:50:02 INFO - 'tests': ['a11yr', 10:50:02 INFO - 'ts_paint', 10:50:02 INFO - 'tpaint', 10:50:02 INFO - 'sessionrestore', 10:50:02 INFO - 'sessionrestore_no_auto_restore', 10:50:02 INFO - 'tabpaint']}, 10:50:02 INFO - 'other-e10s': {'tests': ['a11yr', 10:50:02 INFO - 'ts_paint', 10:50:02 INFO - 'tpaint', 10:50:02 INFO - 'sessionrestore', 10:50:02 INFO - 'sessionrestore_no_auto_restore', 10:50:02 INFO - 'tabpaint']}, 10:50:02 INFO - 'other-e10s_l64': {'tests': ['a11yr', 10:50:02 INFO - 'ts_paint', 10:50:02 INFO - 'tpaint', 10:50:02 INFO - 'sessionrestore', 10:50:02 INFO - 'sessionrestore_no_auto_restore', 10:50:02 INFO - 'tabpaint']}, 10:50:02 INFO - 'other-e10s_nol64': {'tests': ['a11yr', 10:50:02 INFO - 'ts_paint', 10:50:02 INFO - 'tpaint', 10:50:02 INFO - 'sessionrestore', 10:50:02 INFO - 'sessionrestore_no_auto_restore', 10:50:02 INFO - 'tabpaint']}, 10:50:02 INFO - 'other_l64': {'talos_options': ['--disable-e10s'], 10:50:02 INFO - 'tests': ['a11yr', 10:50:02 INFO - 'ts_paint', 10:50:02 INFO - 'tpaint', 10:50:02 INFO - 'sessionrestore', 10:50:02 INFO - 'sessionrestore_no_auto_restore', 10:50:02 INFO - 'tabpaint']}, 10:50:02 INFO - 'other_nol64': {'talos_options': ['--disable-e10s'], 10:50:02 INFO - 'tests': ['a11yr', 10:50:02 INFO - 'ts_paint', 10:50:02 INFO - 'tpaint', 10:50:02 INFO - 'sessionrestore', 10:50:02 INFO - 'sessionrestore_no_auto_restore', 10:50:02 INFO - 'tabpaint']}, 10:50:02 INFO - 'svgr': {'talos_options': ['--disable-e10s'], 10:50:02 INFO - 'tests': ['tsvgx', 10:50:02 INFO - 'tsvgr_opacity', 10:50:02 INFO - 'tart', 10:50:02 INFO - 'tscrollx', 10:50:02 INFO - 'cart']}, 10:50:02 INFO - 'svgr-e10s': {'tests': ['tsvgx', 10:50:02 INFO - 'tsvgr_opacity', 10:50:02 INFO - 'tart', 10:50:02 INFO - 'tscrollx', 10:50:02 INFO - 'cart']}, 10:50:02 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 10:50:02 INFO - 'talos_options': ['--disable-e10s'], 10:50:02 INFO - 'tests': ['tp5o']}, 10:50:02 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 10:50:02 INFO - 'tests': ['tp5o']}, 10:50:02 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 10:50:02 INFO - 'talos_options': ['--disable-e10s', 10:50:02 INFO - '--xperf_path', 10:50:02 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 10:50:02 INFO - 'tests': ['tp5n']}, 10:50:02 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 10:50:02 INFO - 'talos_options': ['--xperf_path', 10:50:02 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 10:50:02 INFO - 'tests': ['tp5n']}}, 10:50:02 INFO - 'talos.zip': {'path': '', 10:50:02 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 10:50:02 INFO - Running post-action listener: _resource_record_post_action 10:50:02 INFO - ##### 10:50:02 INFO - ##### Finished populate-webroot step (success) 10:50:02 INFO - ##### 10:50:02 INFO - ##### 10:50:02 INFO - ##### Running create-virtualenv step. 10:50:02 INFO - ##### 10:50:02 INFO - Running pre-action listener: _resource_record_pre_action 10:50:02 INFO - Running main action method: create_virtualenv 10:50:02 INFO - Creating virtualenv /builds/slave/test/build/venv 10:50:02 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:50:02 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 10:50:02 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 10:50:02 INFO - Using real prefix '/usr' 10:50:02 INFO - New python executable in /builds/slave/test/build/venv/bin/python 10:50:02 INFO - Installing distribute.............................................................................................................................................................................................done. 10:50:04 INFO - Installing pip.................done. 10:50:04 INFO - Return code: 0 10:50:04 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 10:50:04 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 10:50:04 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 10:50:04 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:50:04 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 10:50:04 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 10:50:04 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:50:04 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 0x195f030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1ac28a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1c20180>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1c1e3b0>, '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 0x1c1f2b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1c1f740>, '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': '82c74bd3bc9a11c5833d2010000001e6-1467740990.321698-195106195', '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:50:04 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:50:04 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:50:04 INFO - Using env: {'DISPLAY': ':0', 10:50:04 INFO - 'HOME': '/home/cltbld', 10:50:04 INFO - 'LANG': 'en_US.UTF-8', 10:50:04 INFO - 'LANGUAGE': 'en_US:en', 10:50:04 INFO - 'LOGNAME': 'cltbld', 10:50:04 INFO - 'MAIL': '/var/mail/cltbld', 10:50:04 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 10:50:04 INFO - 'MOZ_NO_REMOTE': '1', 10:50:04 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 10:50:04 INFO - 'NO_EM_RESTART': '1', 10:50:04 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 10:50:04 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 10:50:04 INFO - 'PWD': '/builds/slave/test', 10:50:04 INFO - 'SHELL': '/bin/bash', 10:50:04 INFO - 'SHLVL': '1', 10:50:04 INFO - 'TERM': 'linux', 10:50:04 INFO - 'TMOUT': '86400', 10:50:04 INFO - 'USER': 'cltbld', 10:50:04 INFO - 'XDG_SESSION_COOKIE': '82c74bd3bc9a11c5833d2010000001e6-1467740990.321698-195106195', 10:50:04 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 10:50:04 INFO - '_': '/tools/buildbot/bin/python'} 10:50:04 INFO - Ignoring indexes: https://pypi.python.org/simple/ 10:50:04 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:50:04 INFO - Cleaning up... 10:50:04 INFO - Return code: 0 10:50:04 INFO - Installing psutil>=3.1.1 into virtualenv /builds/slave/test/build/venv 10:50:04 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 10:50:04 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 10:50:04 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:50:04 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 10:50:04 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 10:50:04 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:50:04 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 0x195f030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1ac28a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1c20180>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1c1e3b0>, '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 0x1c1f2b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1c1f740>, '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': '82c74bd3bc9a11c5833d2010000001e6-1467740990.321698-195106195', '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:50:04 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:50:04 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:50:04 INFO - Using env: {'DISPLAY': ':0', 10:50:04 INFO - 'HOME': '/home/cltbld', 10:50:04 INFO - 'LANG': 'en_US.UTF-8', 10:50:04 INFO - 'LANGUAGE': 'en_US:en', 10:50:04 INFO - 'LOGNAME': 'cltbld', 10:50:04 INFO - 'MAIL': '/var/mail/cltbld', 10:50:04 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 10:50:04 INFO - 'MOZ_NO_REMOTE': '1', 10:50:04 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 10:50:04 INFO - 'NO_EM_RESTART': '1', 10:50:04 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 10:50:04 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 10:50:04 INFO - 'PWD': '/builds/slave/test', 10:50:04 INFO - 'SHELL': '/bin/bash', 10:50:04 INFO - 'SHLVL': '1', 10:50:04 INFO - 'TERM': 'linux', 10:50:04 INFO - 'TMOUT': '86400', 10:50:04 INFO - 'USER': 'cltbld', 10:50:04 INFO - 'XDG_SESSION_COOKIE': '82c74bd3bc9a11c5833d2010000001e6-1467740990.321698-195106195', 10:50:04 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 10:50:04 INFO - '_': '/tools/buildbot/bin/python'} 10:50:05 INFO - Ignoring indexes: https://pypi.python.org/simple/ 10:50:05 INFO - Downloading/unpacking psutil>=3.1.1 10:50:05 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:50:05 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:50:05 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:50:05 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:50:05 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:50:05 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:50:07 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 10:50:07 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 10:50:07 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 10:50:07 INFO - Installing collected packages: psutil 10:50:07 INFO - Running setup.py install for psutil 10:50:07 INFO - building 'psutil._psutil_linux' extension 10:50:07 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:50:07 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:50:07 INFO - building 'psutil._psutil_posix' extension 10:50:07 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:50:07 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:50:07 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 10:50:07 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 10:50:07 INFO - Successfully installed psutil 10:50:07 INFO - Cleaning up... 10:50:07 INFO - Return code: 0 10:50:07 INFO - Installing mozsystemmonitor==0.3 into virtualenv /builds/slave/test/build/venv 10:50:07 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 10:50:07 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 10:50:07 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:50:07 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 10:50:07 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 10:50:07 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:50:07 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'mozsystemmonitor==0.3']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x195f030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1ac28a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1c20180>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1c1e3b0>, '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 0x1c1f2b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1c1f740>, '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': '82c74bd3bc9a11c5833d2010000001e6-1467740990.321698-195106195', '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:50:07 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'mozsystemmonitor==0.3'] in /builds/slave/test/build 10:50:07 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub mozsystemmonitor==0.3 10:50:07 INFO - Using env: {'DISPLAY': ':0', 10:50:07 INFO - 'HOME': '/home/cltbld', 10:50:07 INFO - 'LANG': 'en_US.UTF-8', 10:50:07 INFO - 'LANGUAGE': 'en_US:en', 10:50:07 INFO - 'LOGNAME': 'cltbld', 10:50:07 INFO - 'MAIL': '/var/mail/cltbld', 10:50:07 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 10:50:07 INFO - 'MOZ_NO_REMOTE': '1', 10:50:07 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 10:50:07 INFO - 'NO_EM_RESTART': '1', 10:50:07 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 10:50:07 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 10:50:07 INFO - 'PWD': '/builds/slave/test', 10:50:07 INFO - 'SHELL': '/bin/bash', 10:50:07 INFO - 'SHLVL': '1', 10:50:07 INFO - 'TERM': 'linux', 10:50:07 INFO - 'TMOUT': '86400', 10:50:07 INFO - 'USER': 'cltbld', 10:50:07 INFO - 'XDG_SESSION_COOKIE': '82c74bd3bc9a11c5833d2010000001e6-1467740990.321698-195106195', 10:50:07 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 10:50:07 INFO - '_': '/tools/buildbot/bin/python'} 10:50:07 INFO - Ignoring indexes: https://pypi.python.org/simple/ 10:50:07 INFO - Downloading/unpacking mozsystemmonitor==0.3 10:50:07 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:50:07 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:50:07 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:50:07 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:50:07 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:50:07 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:50:09 INFO - Downloading mozsystemmonitor-0.3.tar.gz 10:50:09 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 10:50:09 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.3) 10:50:09 INFO - Installing collected packages: mozsystemmonitor 10:50:09 INFO - Running setup.py install for mozsystemmonitor 10:50:10 INFO - Successfully installed mozsystemmonitor 10:50:10 INFO - Cleaning up... 10:50:10 INFO - Return code: 0 10:50:10 INFO - Installing jsonschema==2.5.1 into virtualenv /builds/slave/test/build/venv 10:50: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://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 10:50:10 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 10:50:10 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:50: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://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 10:50:10 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 10:50:10 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:50:10 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 0x195f030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1ac28a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1c20180>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1c1e3b0>, '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 0x1c1f2b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1c1f740>, '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': '82c74bd3bc9a11c5833d2010000001e6-1467740990.321698-195106195', '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:50:10 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:50:10 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:50:10 INFO - Using env: {'DISPLAY': ':0', 10:50:10 INFO - 'HOME': '/home/cltbld', 10:50:10 INFO - 'LANG': 'en_US.UTF-8', 10:50:10 INFO - 'LANGUAGE': 'en_US:en', 10:50:10 INFO - 'LOGNAME': 'cltbld', 10:50:10 INFO - 'MAIL': '/var/mail/cltbld', 10:50:10 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 10:50:10 INFO - 'MOZ_NO_REMOTE': '1', 10:50:10 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 10:50:10 INFO - 'NO_EM_RESTART': '1', 10:50:10 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 10:50:10 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 10:50:10 INFO - 'PWD': '/builds/slave/test', 10:50:10 INFO - 'SHELL': '/bin/bash', 10:50:10 INFO - 'SHLVL': '1', 10:50:10 INFO - 'TERM': 'linux', 10:50:10 INFO - 'TMOUT': '86400', 10:50:10 INFO - 'USER': 'cltbld', 10:50:10 INFO - 'XDG_SESSION_COOKIE': '82c74bd3bc9a11c5833d2010000001e6-1467740990.321698-195106195', 10:50:10 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 10:50:10 INFO - '_': '/tools/buildbot/bin/python'} 10:50:10 INFO - Ignoring indexes: https://pypi.python.org/simple/ 10:50:10 INFO - Downloading/unpacking jsonschema==2.5.1 10:50:10 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:50:10 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:50:10 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:50:10 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:50:10 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:50:10 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:50:12 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 10:50:12 INFO - Downloading/unpacking functools32 (from jsonschema==2.5.1) 10:50:12 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 10:50:12 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 10:50:12 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 10:50:12 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 10:50:12 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 10:50:12 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 10:50:12 INFO - Downloading functools32-3.2.3-2.tar.gz 10:50:12 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/functools32/setup.py) egg_info for package functools32 10:50:12 INFO - warning: no files found matching '*.txt' 10:50:12 INFO - no previously-included directories found matching 'build' 10:50:12 INFO - no previously-included directories found matching 'dist' 10:50:12 INFO - no previously-included directories found matching '.git*' 10:50:12 INFO - Installing collected packages: jsonschema, functools32 10:50:12 INFO - Running setup.py install for functools32 10:50:12 INFO - warning: no files found matching '*.txt' 10:50:12 INFO - no previously-included directories found matching 'build' 10:50:12 INFO - no previously-included directories found matching 'dist' 10:50:12 INFO - no previously-included directories found matching '.git*' 10:50:12 INFO - Successfully installed jsonschema functools32 10:50:12 INFO - Cleaning up... 10:50:12 INFO - Return code: 0 10:50:12 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 10:50:12 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 10:50:12 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 10:50:12 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:50:12 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 10:50:12 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 10:50:12 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:50:12 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', '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 0x195f030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1ac28a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1c20180>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1c1e3b0>, '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 0x1c1f2b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1c1f740>, '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': '82c74bd3bc9a11c5833d2010000001e6-1467740990.321698-195106195', '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:50:12 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'blobuploader==1.2.4'] in /builds/slave/test/build 10:50:12 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub blobuploader==1.2.4 10:50:12 INFO - Using env: {'DISPLAY': ':0', 10:50:12 INFO - 'HOME': '/home/cltbld', 10:50:12 INFO - 'LANG': 'en_US.UTF-8', 10:50:12 INFO - 'LANGUAGE': 'en_US:en', 10:50:12 INFO - 'LOGNAME': 'cltbld', 10:50:12 INFO - 'MAIL': '/var/mail/cltbld', 10:50:12 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 10:50:12 INFO - 'MOZ_NO_REMOTE': '1', 10:50:12 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 10:50:12 INFO - 'NO_EM_RESTART': '1', 10:50:12 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 10:50:12 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 10:50:12 INFO - 'PWD': '/builds/slave/test', 10:50:12 INFO - 'SHELL': '/bin/bash', 10:50:12 INFO - 'SHLVL': '1', 10:50:12 INFO - 'TERM': 'linux', 10:50:12 INFO - 'TMOUT': '86400', 10:50:12 INFO - 'USER': 'cltbld', 10:50:12 INFO - 'XDG_SESSION_COOKIE': '82c74bd3bc9a11c5833d2010000001e6-1467740990.321698-195106195', 10:50:12 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 10:50:12 INFO - '_': '/tools/buildbot/bin/python'} 10:50:12 INFO - Ignoring indexes: https://pypi.python.org/simple/ 10:50:12 INFO - Downloading/unpacking blobuploader==1.2.4 10:50:12 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 10:50:12 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 10:50:12 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 10:50:12 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 10:50:12 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 10:50:12 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 10:50:14 INFO - Downloading blobuploader-1.2.4.tar.gz 10:50:14 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 10:50:14 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 10:50:14 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:50:14 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:50:14 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:50:14 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:50:14 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:50:14 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:50:15 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 10:50:15 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 10:50:15 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 10:50:15 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 10:50:15 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 10:50:15 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 10:50:15 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 10:50:15 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 10:50:15 INFO - Downloading docopt-0.6.1.tar.gz 10:50:15 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 10:50:15 INFO - Installing collected packages: blobuploader, requests, docopt 10:50:15 INFO - Running setup.py install for blobuploader 10:50:15 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 10:50:15 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 10:50:15 INFO - Running setup.py install for requests 10:50:15 INFO - Running setup.py install for docopt 10:50:16 INFO - Successfully installed blobuploader requests docopt 10:50:16 INFO - Cleaning up... 10:50:16 INFO - Return code: 0 10:50:16 INFO - Installing None into virtualenv /builds/slave/test/build/venv 10:50:16 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 10:50:16 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 10:50:16 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:50:16 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 10:50:16 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 10:50:16 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:50:16 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 0x195f030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1ac28a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1c20180>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1c1e3b0>, '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 0x1c1f2b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1c1f740>, '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': '82c74bd3bc9a11c5833d2010000001e6-1467740990.321698-195106195', '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:50:16 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:50:16 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:50:16 INFO - Using env: {'DISPLAY': ':0', 10:50:16 INFO - 'HOME': '/home/cltbld', 10:50:16 INFO - 'LANG': 'en_US.UTF-8', 10:50:16 INFO - 'LANGUAGE': 'en_US:en', 10:50:16 INFO - 'LOGNAME': 'cltbld', 10:50:16 INFO - 'MAIL': '/var/mail/cltbld', 10:50:16 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 10:50:16 INFO - 'MOZ_NO_REMOTE': '1', 10:50:16 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 10:50:16 INFO - 'NO_EM_RESTART': '1', 10:50:16 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 10:50:16 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 10:50:16 INFO - 'PWD': '/builds/slave/test', 10:50:16 INFO - 'SHELL': '/bin/bash', 10:50:16 INFO - 'SHLVL': '1', 10:50:16 INFO - 'TERM': 'linux', 10:50:16 INFO - 'TMOUT': '86400', 10:50:16 INFO - 'USER': 'cltbld', 10:50:16 INFO - 'XDG_SESSION_COOKIE': '82c74bd3bc9a11c5833d2010000001e6-1467740990.321698-195106195', 10:50:16 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 10:50:16 INFO - '_': '/tools/buildbot/bin/python'} 10:50:16 INFO - Ignoring indexes: https://pypi.python.org/simple/ 10:50:16 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 10:50:16 INFO - Running setup.py (path:/tmp/pip-r41TKk-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 10:50:16 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 10:50:16 INFO - Running setup.py (path:/tmp/pip-wYIa7N-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 10:50:16 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 10:50:16 INFO - Running setup.py (path:/tmp/pip-5mBgNo-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 10:50:16 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 10:50:16 INFO - Running setup.py (path:/tmp/pip-yMV_M0-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 10:50:16 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 10:50:16 INFO - Running setup.py (path:/tmp/pip-DWrEMd-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 10:50:16 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 10:50:16 INFO - Running setup.py (path:/tmp/pip-_GWibW-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 10:50:16 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 10:50:16 INFO - Running setup.py (path:/tmp/pip-qcjwq3-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 10:50:16 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 10:50:16 INFO - Running setup.py (path:/tmp/pip-B8v6OZ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 10:50:16 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 10:50:16 INFO - Running setup.py (path:/tmp/pip-UBj0kE-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 10:50:16 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 10:50:16 INFO - Running setup.py (path:/tmp/pip-K9ifPM-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 10:50:17 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 10:50:17 INFO - Running setup.py (path:/tmp/pip-zFBTPp-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 10:50:17 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 10:50:17 INFO - Running setup.py (path:/tmp/pip-xypkAL-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 10:50:17 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 10:50:17 INFO - Running setup.py (path:/tmp/pip-48awGn-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 10:50:17 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 10:50:17 INFO - Running setup.py (path:/tmp/pip-OIcnjE-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 10:50:17 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 10:50:17 INFO - Running setup.py (path:/tmp/pip-xWlCNW-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 10:50:17 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 10:50:17 INFO - Running setup.py (path:/tmp/pip-3ENnFc-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 10:50:17 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 10:50:17 INFO - Running setup.py (path:/tmp/pip-ZOB9qF-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 10:50:17 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 10:50:17 INFO - Running setup.py install for manifestparser 10:50:17 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 10:50:17 INFO - Running setup.py install for mozcrash 10:50:17 INFO - Running setup.py install for mozdebug 10:50:17 INFO - Running setup.py install for mozdevice 10:50:17 INFO - Installing sutini script to /builds/slave/test/build/venv/bin 10:50:17 INFO - Installing dm script to /builds/slave/test/build/venv/bin 10:50:17 INFO - Running setup.py install for mozfile 10:50:18 INFO - Running setup.py install for mozhttpd 10:50:18 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 10:50:18 INFO - Running setup.py install for mozinfo 10:50:18 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 10:50:18 INFO - Running setup.py install for mozInstall 10:50:18 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 10:50:18 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 10:50:18 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 10:50:18 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 10:50:18 INFO - Running setup.py install for mozleak 10:50:18 INFO - Running setup.py install for mozlog 10:50:18 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 10:50:18 INFO - Running setup.py install for moznetwork 10:50:18 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 10:50:18 INFO - Running setup.py install for mozprocess 10:50:18 INFO - Running setup.py install for mozprofile 10:50:18 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 10:50:18 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 10:50:18 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 10:50:18 INFO - Running setup.py install for mozrunner 10:50:19 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 10:50:19 INFO - Running setup.py install for mozscreenshot 10:50:19 INFO - Running setup.py install for moztest 10:50:19 INFO - Running setup.py install for mozversion 10:50:19 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 10:50:19 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 10:50:19 INFO - Cleaning up... 10:50:19 INFO - Return code: 0 10:50:19 INFO - Installing None into virtualenv /builds/slave/test/build/venv 10:50:19 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 10:50:19 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 10:50:19 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:50:19 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 10:50:19 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 10:50:19 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:50:19 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 0x195f030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1ac28a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1c20180>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1c1e3b0>, '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 0x1c1f2b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1c1f740>, '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': '82c74bd3bc9a11c5833d2010000001e6-1467740990.321698-195106195', '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:50:19 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:50:19 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:50:19 INFO - Using env: {'DISPLAY': ':0', 10:50:19 INFO - 'HOME': '/home/cltbld', 10:50:19 INFO - 'LANG': 'en_US.UTF-8', 10:50:19 INFO - 'LANGUAGE': 'en_US:en', 10:50:19 INFO - 'LOGNAME': 'cltbld', 10:50:19 INFO - 'MAIL': '/var/mail/cltbld', 10:50:19 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 10:50:19 INFO - 'MOZ_NO_REMOTE': '1', 10:50:19 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 10:50:19 INFO - 'NO_EM_RESTART': '1', 10:50:19 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 10:50:19 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 10:50:19 INFO - 'PWD': '/builds/slave/test', 10:50:19 INFO - 'SHELL': '/bin/bash', 10:50:19 INFO - 'SHLVL': '1', 10:50:19 INFO - 'TERM': 'linux', 10:50:19 INFO - 'TMOUT': '86400', 10:50:19 INFO - 'USER': 'cltbld', 10:50:19 INFO - 'XDG_SESSION_COOKIE': '82c74bd3bc9a11c5833d2010000001e6-1467740990.321698-195106195', 10:50:19 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 10:50:19 INFO - '_': '/tools/buildbot/bin/python'} 10:50:19 INFO - Ignoring indexes: https://pypi.python.org/simple/ 10:50:19 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 10:50:19 INFO - Running setup.py (path:/tmp/pip-uXGQH2-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 10:50:19 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:50:19 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 10:50:19 INFO - Running setup.py (path:/tmp/pip-myZ4Ms-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 10:50:19 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:50:19 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 10:50:19 INFO - Running setup.py (path:/tmp/pip-mbE96S-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 10:50:19 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:50:19 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 10:50:19 INFO - Running setup.py (path:/tmp/pip-U832DW-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 10:50:19 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:50:19 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 10:50:19 INFO - Running setup.py (path:/tmp/pip-1bR5Na-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 10:50:19 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:50:19 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 10:50:19 INFO - Running setup.py (path:/tmp/pip-6Ec9Nf-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 10:50:20 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:50:20 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 10:50:20 INFO - Running setup.py (path:/tmp/pip-x94eWt-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 10:50:20 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:50:20 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 10:50:20 INFO - Running setup.py (path:/tmp/pip-oL74zK-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 10:50:20 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:50:20 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 10:50:20 INFO - Running setup.py (path:/tmp/pip-xwrHjQ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 10:50:20 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:50:20 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 10:50:20 INFO - Running setup.py (path:/tmp/pip-3kaiqz-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 10:50:20 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog==3.2 from file:///builds/slave/test/build/tests/mozbase/mozlog in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 10:50:20 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 10:50:20 INFO - Running setup.py (path:/tmp/pip-0XsFE7-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 10:50:20 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:50:20 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 10:50:20 INFO - Running setup.py (path:/tmp/pip-epTijA-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 10:50:20 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess==0.22 from file:///builds/slave/test/build/tests/mozbase/mozprocess in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 12)) 10:50:20 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 10:50:20 INFO - Running setup.py (path:/tmp/pip-SPMSYm-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 10:50:20 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:50:20 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 10:50:20 INFO - Running setup.py (path:/tmp/pip-oVb48v-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 10:50:20 INFO - Requirement already satisfied (use --upgrade to upgrade): mozrunner==6.11 from file:///builds/slave/test/build/tests/mozbase/mozrunner in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 14)) 10:50:20 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 10:50:20 INFO - Running setup.py (path:/tmp/pip-zwWHxW-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 10:50:20 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:50:20 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 10:50:20 INFO - Running setup.py (path:/tmp/pip-0yyDRi-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 10:50:20 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:50:20 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 10:50:20 INFO - Running setup.py (path:/tmp/pip-auXy3E-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 10:50:20 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:50:20 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:50:20 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:50:20 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:50:20 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:50:20 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:50:20 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.2->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 10:50:20 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 10:50:20 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 10:50:20 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 10:50:20 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 10:50:20 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 10:50:20 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 10:50:22 INFO - Downloading blessings-1.6.tar.gz 10:50:22 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 10:50:22 INFO - Installing collected packages: blessings 10:50:22 INFO - Running setup.py install for blessings 10:50:22 INFO - Successfully installed blessings 10:50:22 INFO - Cleaning up... 10:50:22 INFO - Return code: 0 10:50:22 INFO - Done creating virtualenv /builds/slave/test/build/venv. 10:50:22 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 10:50:22 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 10:50:23 INFO - Reading from file tmpfile_stdout 10:50:23 INFO - Current package versions: 10:50:23 INFO - argparse == 1.2.1 10:50:23 INFO - blessings == 1.6 10:50:23 INFO - blobuploader == 1.2.4 10:50:23 INFO - docopt == 0.6.1 10:50:23 INFO - functools32 == 3.2.3-2 10:50:23 INFO - jsonschema == 2.5.1 10:50:23 INFO - manifestparser == 1.1 10:50:23 INFO - mozInstall == 1.12 10:50:23 INFO - mozcrash == 0.17 10:50:23 INFO - mozdebug == 0.1 10:50:23 INFO - mozdevice == 0.48 10:50:23 INFO - mozfile == 1.2 10:50:23 INFO - mozhttpd == 0.7 10:50:23 INFO - mozinfo == 0.9 10:50:23 INFO - mozleak == 0.1 10:50:23 INFO - mozlog == 3.2 10:50:23 INFO - moznetwork == 0.27 10:50:23 INFO - mozprocess == 0.22 10:50:23 INFO - mozprofile == 0.28 10:50:23 INFO - mozrunner == 6.11 10:50:23 INFO - mozscreenshot == 0.1 10:50:23 INFO - mozsystemmonitor == 0.3 10:50:23 INFO - moztest == 0.7 10:50:23 INFO - mozversion == 1.4 10:50:23 INFO - psutil == 3.1.1 10:50:23 INFO - requests == 1.2.3 10:50:23 INFO - wsgiref == 0.1.2 10:50:23 INFO - Installing None into virtualenv /builds/slave/test/build/venv 10:50:23 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 10:50:23 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 10:50:23 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:50:23 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 10:50:23 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 10:50:23 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:50:23 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 0x195f030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1ac28a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1c20180>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1c1e3b0>, '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 0x1c1f2b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1c1f740>, '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': '82c74bd3bc9a11c5833d2010000001e6-1467740990.321698-195106195', '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:50:23 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:50:23 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:50:23 INFO - Using env: {'DISPLAY': ':0', 10:50:23 INFO - 'HOME': '/home/cltbld', 10:50:23 INFO - 'LANG': 'en_US.UTF-8', 10:50:23 INFO - 'LANGUAGE': 'en_US:en', 10:50:23 INFO - 'LOGNAME': 'cltbld', 10:50:23 INFO - 'MAIL': '/var/mail/cltbld', 10:50:23 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 10:50:23 INFO - 'MOZ_NO_REMOTE': '1', 10:50:23 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 10:50:23 INFO - 'NO_EM_RESTART': '1', 10:50:23 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 10:50:23 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 10:50:23 INFO - 'PWD': '/builds/slave/test', 10:50:23 INFO - 'SHELL': '/bin/bash', 10:50:23 INFO - 'SHLVL': '1', 10:50:23 INFO - 'TERM': 'linux', 10:50:23 INFO - 'TMOUT': '86400', 10:50:23 INFO - 'USER': 'cltbld', 10:50:23 INFO - 'XDG_SESSION_COOKIE': '82c74bd3bc9a11c5833d2010000001e6-1467740990.321698-195106195', 10:50:23 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 10:50:23 INFO - '_': '/tools/buildbot/bin/python'} 10:50:23 INFO - Ignoring indexes: https://pypi.python.org/simple/ 10:50:23 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:50:23 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:50:23 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:50:23 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:50:23 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:50:23 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:50:23 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:50:23 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:50:23 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:50:23 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:50:23 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:50:23 INFO - Cleaning up... 10:50:23 INFO - Return code: 0 10:50:23 INFO - Installing jsonschema into virtualenv /builds/slave/test/build/venv 10:50:23 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 10:50:23 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 10:50:23 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:50:23 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 10:50:23 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 10:50:23 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 10:50:23 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 0x195f030>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1ac28a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1c20180>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1c1e3b0>, '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 0x1c1f2b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1c1f740>, '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': '82c74bd3bc9a11c5833d2010000001e6-1467740990.321698-195106195', '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:50:23 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:50:23 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:50:23 INFO - Using env: {'DISPLAY': ':0', 10:50:23 INFO - 'HOME': '/home/cltbld', 10:50:23 INFO - 'LANG': 'en_US.UTF-8', 10:50:23 INFO - 'LANGUAGE': 'en_US:en', 10:50:23 INFO - 'LOGNAME': 'cltbld', 10:50:23 INFO - 'MAIL': '/var/mail/cltbld', 10:50:23 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 10:50:23 INFO - 'MOZ_NO_REMOTE': '1', 10:50:23 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 10:50:23 INFO - 'NO_EM_RESTART': '1', 10:50:23 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 10:50:23 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 10:50:23 INFO - 'PWD': '/builds/slave/test', 10:50:23 INFO - 'SHELL': '/bin/bash', 10:50:23 INFO - 'SHLVL': '1', 10:50:23 INFO - 'TERM': 'linux', 10:50:23 INFO - 'TMOUT': '86400', 10:50:23 INFO - 'USER': 'cltbld', 10:50:23 INFO - 'XDG_SESSION_COOKIE': '82c74bd3bc9a11c5833d2010000001e6-1467740990.321698-195106195', 10:50:23 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 10:50:23 INFO - '_': '/tools/buildbot/bin/python'} 10:50:23 INFO - Ignoring indexes: https://pypi.python.org/simple/ 10:50:23 INFO - Requirement already satisfied (use --upgrade to upgrade): jsonschema in ./venv/lib/python2.7/site-packages 10:50:23 INFO - Cleaning up... 10:50:23 INFO - Return code: 0 10:50:23 INFO - Running post-action listener: _resource_record_post_action 10:50:23 INFO - Running post-action listener: _start_resource_monitoring 10:50:23 INFO - Starting resource monitoring. 10:50:23 INFO - ##### 10:50:23 INFO - ##### Finished create-virtualenv step (success) 10:50:23 INFO - ##### 10:50:23 INFO - ##### 10:50:23 INFO - ##### Running install step. 10:50:23 INFO - ##### 10:50:23 INFO - Running pre-action listener: _resource_record_pre_action 10:50:23 INFO - Running main action method: install 10:50:23 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 10:50:23 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 10:50:23 INFO - Reading from file tmpfile_stdout 10:50:23 INFO - Detecting whether we're running mozinstall >=1.0... 10:50:23 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 10:50:23 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 10:50:23 INFO - Reading from file tmpfile_stdout 10:50:23 INFO - Output received: 10:50:23 INFO - Usage: mozinstall [options] installer 10:50:23 INFO - Options: 10:50:23 INFO - -h, --help show this help message and exit 10:50:23 INFO - -d DEST, --destination=DEST 10:50:23 INFO - Directory to install application into. [default: 10:50:23 INFO - "/builds/slave/test"] 10:50:23 INFO - --app=APP Application being installed. [default: firefox] 10:50:23 INFO - mkdir: /builds/slave/test/build/application 10:50:23 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '/builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2', '--destination', '/builds/slave/test/build/application'] 10:50:23 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall /builds/slave/test/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 --destination /builds/slave/test/build/application 10:50:41 INFO - Reading from file tmpfile_stdout 10:50:41 INFO - Output received: 10:50:41 INFO - /builds/slave/test/build/application/firefox/firefox 10:50:41 INFO - Running post-action listener: _resource_record_post_action 10:50:41 INFO - ##### 10:50:41 INFO - ##### Finished install step (success) 10:50:41 INFO - ##### 10:50:41 INFO - ##### 10:50:41 INFO - ##### Running run-tests step. 10:50:41 INFO - ##### 10:50:41 INFO - Running pre-action listener: _resource_record_pre_action 10:50:41 INFO - Running main action method: run_tests 10:50:41 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 10:50:41 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 10:50:41 INFO - Python 2.7.3 10:50:41 INFO - Return code: 0 10:50:41 INFO - grabbing minidump binary from tooltool 10:50: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://pvtbuilds.pvt.build.mozilla.org', 'pvtbuilds.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org'), ('https://queue.taskcluster.net', 'queue.taskcluster.net')]} 10:50:41 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 0x1c1e3b0>, '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 0x1c1f2b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1c1f740>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 10:50:41 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:50:41 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:50:41 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:50:41 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 10:50:41 INFO - Return code: 0 10:50:41 INFO - Chmoding /builds/slave/test/build/linux64-minidump_stackwalk to 0755 10:50:41 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 10:50:41 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 10:50:41 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/linux64-minidump_stackwalk 10:50:41 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 10:50:41 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Mozilla-Inbound', '--suite', 'dromaeojs', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/RjvOvvIeT1-zobCVCBuK3w/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-066', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log'] in /builds/slave/test/build 10:50:41 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/tests/talos/talos/run_tests.py --branchName Mozilla-Inbound --suite dromaeojs --executablePath /builds/slave/test/build/application/firefox/firefox --symbolsPath https://queue.taskcluster.net/v1/task/RjvOvvIeT1-zobCVCBuK3w/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.crashreporter-symbols.zip --title talos-linux64-ix-066 --webServer localhost --log-tbpl-level=debug --log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log --log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log 10:50:41 INFO - Using env: {'DISPLAY': ':0', 10:50:41 INFO - 'HOME': '/home/cltbld', 10:50:41 INFO - 'LANG': 'en_US.UTF-8', 10:50:41 INFO - 'LANGUAGE': 'en_US:en', 10:50:41 INFO - 'LOGNAME': 'cltbld', 10:50:41 INFO - 'MAIL': '/var/mail/cltbld', 10:50:41 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 10:50:41 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/linux64-minidump_stackwalk', 10:50:41 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 10:50:41 INFO - 'MOZ_NO_REMOTE': '1', 10:50:41 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 10:50:41 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 10:50:41 INFO - 'NO_EM_RESTART': '1', 10:50:41 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 10:50:41 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 10:50:41 INFO - 'PWD': '/builds/slave/test', 10:50:41 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 10:50:41 INFO - 'SHELL': '/bin/bash', 10:50:41 INFO - 'SHLVL': '1', 10:50:41 INFO - 'TERM': 'linux', 10:50:41 INFO - 'TMOUT': '86400', 10:50:41 INFO - 'USER': 'cltbld', 10:50:41 INFO - 'XDG_SESSION_COOKIE': '82c74bd3bc9a11c5833d2010000001e6-1467740990.321698-195106195', 10:50:41 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 10:50:41 INFO - '_': '/tools/buildbot/bin/python'} 10:50:41 INFO - Calling ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Mozilla-Inbound', '--suite', 'dromaeojs', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/RjvOvvIeT1-zobCVCBuK3w/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-066', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log'] with output_timeout 3600 10:50:41 INFO - mozversion application_buildid: 20160704013020 10:50:41 INFO - mozversion application_changeset: 55eb13faa8e016818d8fd96e6e30e3fb89dd0af7 10:50:41 INFO - mozversion application_display_name: Nightly 10:50:41 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 10:50:41 INFO - mozversion application_name: Firefox 10:50:41 INFO - mozversion application_remotingname: firefox 10:50:41 INFO - mozversion application_repository: https://hg.mozilla.org/integration/mozilla-inbound 10:50:41 INFO - mozversion application_vendor: Mozilla 10:50:41 INFO - mozversion application_version: 50.0a1 10:50:41 INFO - mozversion platform_buildid: 20160704013020 10:50:41 INFO - mozversion platform_changeset: 55eb13faa8e016818d8fd96e6e30e3fb89dd0af7 10:50:41 INFO - mozversion platform_repository: https://hg.mozilla.org/integration/mozilla-inbound 10:50:41 INFO - mozversion platform_version: 50.0a1 10:50:41 INFO - using testdate: 1467741041 10:50:41 INFO - actual date: 1467741041 10:50:41 INFO - starting webserver on 'localhost:54629' 10:50:41 INFO - SUITE-START | Running 2 tests 10:50:41 INFO - TEST-START | dromaeo_css 10:50:41 INFO - operating with platform_type : linux_ 10:50:41 INFO - Initialising browser for dromaeo_css test... 10:50:41 INFO - TEST-INFO | started process 2658 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmp4FSLJ8/profile http://localhost:54629/getInfo.html) 10:50:45 INFO - PROCESS | 2658 | __metrics Screen width/height:1600/1200 10:50:45 INFO - PROCESS | 2658 | colorDepth:24 10:50:45 INFO - PROCESS | 2658 | Browser inner width/height: 1024/697 10:50:45 INFO - PROCESS | 2658 | __metrics 10:50:46 INFO - PROCESS | 2658 | JavaScript error: resource://app/modules/CaptivePortalWatcher.jsm, line 60: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 10:50:47 INFO - TEST-INFO | 2658: exit 0 10:50:47 INFO - Browser initialized. 10:50:47 INFO - Running cycle 1/1 for dromaeo_css test... 10:50:47 INFO - TEST-INFO | started process 2751 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmp4FSLJ8/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 10:50:59 INFO - PROCESS | 2751 | RSS: Main: 157192192 10:50:59 INFO - PROCESS | 2751 | 10:51:51 INFO - PROCESS | 2751 | 1467741111024 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:53:58 INFO - PROCESS | 2751 | Cycle 1(1): loaded http://localhost:54629/tests/dromaeo/cssquery-dojo.html (next: http://localhost:54629/tests/dromaeo/cssquery-ext.html) 10:53:59 INFO - PROCESS | 2751 | RSS: Main: 288919552 10:53:59 INFO - PROCESS | 2751 | 10:57:02 INFO - PROCESS | 2751 | Cycle 1(1): loaded http://localhost:54629/tests/dromaeo/cssquery-ext.html (next: http://localhost:54629/tests/dromaeo/cssquery-jquery.html) 10:57:03 INFO - PROCESS | 2751 | RSS: Main: 243683328 10:57:03 INFO - PROCESS | 2751 | 11:00:05 INFO - PROCESS | 2751 | Cycle 1(1): loaded http://localhost:54629/tests/dromaeo/cssquery-jquery.html (next: http://localhost:54629/tests/dromaeo/cssquery-mootools.html) 11:00:05 INFO - PROCESS | 2751 | RSS: Main: 234647552 11:00:05 INFO - PROCESS | 2751 | 11:03:08 INFO - PROCESS | 2751 | Cycle 1(1): loaded http://localhost:54629/tests/dromaeo/cssquery-mootools.html (next: http://localhost:54629/tests/dromaeo/cssquery-prototype.html) 11:03:08 INFO - PROCESS | 2751 | RSS: Main: 227090432 11:03:08 INFO - PROCESS | 2751 | 11:06:11 INFO - PROCESS | 2751 | Cycle 1(1): loaded http://localhost:54629/tests/dromaeo/cssquery-prototype.html (next: http://localhost:54629/tests/dromaeo/cssquery-yui.html) 11:06:11 INFO - PROCESS | 2751 | RSS: Main: 202457088 11:06:11 INFO - PROCESS | 2751 | 11:09:14 INFO - PROCESS | 2751 | Cycle 1(1): loaded http://localhost:54629/tests/dromaeo/cssquery-yui.html (next: http://localhost:54629/tests/dromaeo/cssquery-dojo.html) 11:09:14 INFO - PROCESS | 2751 | RSS: Main: 272601088 11:09:14 INFO - PROCESS | 2751 | 11:09:14 INFO - PROCESS | 2751 | __start_tp_report 11:09:14 INFO - PROCESS | 2751 | _x_x_mozilla_page_load 11:09:14 INFO - PROCESS | 2751 | _x_x_mozilla_page_load_details 11:09:14 INFO - PROCESS | 2751 | |i|pagename|runs| 11:09:14 INFO - PROCESS | 2751 | |0;dojo.html;3114.128044147639;3138.7802853800245;3162.2884850908536;3163.8101713897163;3175.6983086606765;5181.715005674687;5247.947520524794;5261.316028916241;5368.812091576796;5386.030514507392;5249.028929648009;5257.158854583267;5279.524842764151;5300.310959575259;5335.1997200419955;4728.408948881382;4762.095201911643;4796.4244290685165;4802.567768900798;4926.778294976734;4892.975535122319;4934.481879402665;4934.753262336887;4943.901121977577;4959.082569724613;4648.163330600491;4683.672142949978;4759.309900064472;4799.016201678647;4819.2771084337455;4711.8350857719815;4729.456112547066;4744.122337367564;4782.545658162504;4868.756562171877;4721;4747.786349614275;4751.904961900777;4789.592884604813;4814.374131362935;5084.110280700863;5149.665271757323;5195.896082078375;5220.347456567929;5277.340332458442;5509.779608815643;5554.805581804618;5569.66582005081;5583.162525621149;5594.13290939905;5569.8607534811545;5585.190147428641;5609.719514024282;5622.522085622727;5638.210650508932;5042.369703787027;5172.948270517284;5190.273361729323;5193.844184674465;5207.3490813648295;5622.072358060874;5681.460261275172;5696.971515142398;5706.657600543981;5710.114932185435;5439.700816455133;5489.094299440628;5533.391326954032;5543.196236545678;5547;5474.315710536183;5591.916121258185;5625.043742563774;5651.717414129359;5709.25779648643;5648.124540696199;5654.321481422256;5671.092625180034;5671.262735844314;5682.971585142131;5342.198670199424;5676.545876329884;5685.5167310778215;5701.2018317435595;5701.372848986608;4188.685848561309;4222.113356195234;4242.936355954663;4250.681198910094;4259.5101563319995;3823.9044023899623;3829.195868867513;3840.251151025523;3853.3641949078087;3867.5165604299464;5105.923411148836;5252.290940722954;5254.97372513135;5258.8159414420315;5301.734913254322;5680.091185410314;5686.630369026;5708.600397972102;5754.856128596735;5761.423857614205;5346.8663283417445;5382.407935127133;5386.111291636836;5386.380566234933;5388.54197393226;4623.329617205486;4700.7179569225955;4765.142274390643;4770.689905156223;4805.087033463631;5835.066389377679;5886.293644762656;5913.408659134052;5916.349201587908;5960.493358064527;5630.493255607015;5635.6618602883955;5643.746031428677;5646.153077038312;5668.858278543069;5714.685692286964;5753.942460575341;5791.131330300489;5869.354371019099;5882.882342353215;5530.142827861688;5539.584531160099;5544.972275138599;5547.362053363753;5587.8882422352135;5629.043062679436;5639.407862174413;5641.097424412074;5644.068728659725;5644.717764111861;5289.444608316226;5354.464553544614;5355.651882627617;5368.382635996911;5449.426506597348;5346.0644387231305;5349.037173308841;5356.330458692663;5381.973090134525;5383.946160538345;5294.205869119509;5296.523312901857;5316.973415132899;5339.252504649275;5364.946350536601;5210.687358758487;5296.947030529799;5470.261514695465;5524.475174858382;5537.1140617501005;5151.5106064923775;5318.7074710891275;5331.3868905076415;5333.226682131147;5382.973085134549 11:09:14 INFO - PROCESS | 2751 | |1;ext.html;585.0843430031999;610.5146408605159;613.6502193749565;629.7292164369319;636.5448704176514;41279.58720412795;41468.79265603671;42327;42425.15149697008;45481.31778023332;43221.245662977046;43720.12559748803;43812.561874381325;43819.342709859375;43840;8169.550674712888;9018.68434604789;9201.079892010812;10713.78572428551;11021.559137634486;10596.258261921668;11006.339619622848;11015.339079655207;11020.063294619928;11021.44892755363;11011.944940275287;11060;11066.667999960015;11075.335479871193;11077.335359878432;10910.945445272762;10961.671149865517;10973.396463194522;10990.065844403236;10997.395143267117;10910.23628346016;10955.780884382268;10957.56169753209;10970.122390208844;10972.670819875417;43090.35364469535;43305.35041974373;43355.783221084006;43428.78285608583;43444.565554344365;3588.1209103769743;3637.7999210043436;3690.9446358304376;3756.9624303756887;4004.599540046001;33200;33623;34312.14219644504;34525;34587;4408.25059739845;4408.823647054114;4442.666799990014;4503.752293623849;4615.976920115378;345656;348971;349134.99999999744;349196;350363;62705.68647156735;62834.685826570574;63143;63203;63334;66110;66159;66322.66838665775;66366.66816665886;66394.33605663978;17036;17496.125193740263;17511.73732394015;17513.912430437766;17528.12359382026;12154.939225303993;12156.756864862653;12168.878311216951;12172.330521821385;12200.877991219973;19142.138603762865;19983.300584479475;20035.599288014157;20110.497237568885;20143;7104.147502299757;7198.352148306678;7305.305995930378;7321.853562928818;7452.85094298111;1008.6620981971122;1027.5581499954942;1101.2896681640298;1127.1884243344778;1181.0964612071773;32384;32425.35149297048;32578.83710581432;33008.774496917154;33053.3389332212;1116.2242241642143;1119.4290911634962;1134.5631931706353;1188.4592510407745;1211.51539384247;17044.573885652957;17127;17196.398126065527;17198.484045478657;17549;530305;534993;536283;538083;538952;55638.721806390706;56079.439205608236;56084.719576401854;56146;56209;1206.258151236983;1286.7619490394306;1328.548293580168;1356.1185229600642;1364.4201214483805;31937.361252775278;33695.15762105967;34027;34033.829830850686;34194.05049298327;49308.26037609367;49867.750661246464;49919.75040124921;49985.75007125086;49999;400492;401943;402543.9872800617;403909;404091;38078.619213807506;41590.376144358466;41950.79024604857;43069.784651076545;43552;46159.53840461552;46555.30167047429;46892.29661555147;47779;48186.5181348182;40063.79968100141;40625.59374406218;40895.795521022206;41421.585784142975;41551.376729349686;40302.798486007385;40306;40870.59129408668;40910.18179636331;41001.38497922474;40603.59396405998;41182.38226426666;41185.38221926614;41340.1731965353;42239.788801055794;35659;37335.43996839995;37344.43983340198;37780.244395112495;37861;27963.720362796925;28097.297567560974;28244.293892652026;28629.713702862704;28885.42229155363 11:09:14 INFO - PROCESS | 2751 | |2;jquery.html;387.42080589518673;392.10208622255044;394.3532606525301;400.51537639456257;419.7565412061005;13595.796063059062;19123.42629721107;20720.792792072058;20742.688859667116;21295.361139165812;15080.396784128621;19670.90164549175;19717;19998.90000549999;20636.896815515902;5746.281714785652;5891.410858914117;5904.084866845646;5904.911426328608;5927.911081333784;5873.2658417697785;5902.380250073745;5903.291605007405;5904.084866845646;5914.349421563625;4112.938305925413;4153.792310384484;6484.6433446160445;6531.836704082389;6647.302033286508;6440.645764482952;6575.342465753434;6627.86744265112;6638.701258443358;6647.867042659144;5673.914891276634;5751.281089863767;5778.0466223073145;5796;5799.043157878945;23536.76463235363;24192.637110443357;25078.874605626854;25176.874115629304;25244;2452.644366566838;2460.015993602555;2517.1567524879188;2756.3109222694325;2887.581300711406;13732.313384330744;14365.066270692372;14418.495352662607;14699.485518006819;14947.551573452814;1935.7289979402894;1977.2980591889816;1989.8408127349778;2028.8275496582808;2064.6593312103487;83061;84407;85260.14739852583;85692.57153714253;85860;10523.68453943257;10831.458427078773;10959.287646302964;11084.057855082408;11259.831102533468;15287.464938727313;15406;15409.537713868602;15445.30496127677;15445.84554154444;8183.672653093929;8206.917930820735;8296.792580185544;8361.205685459872;8382.748517544484;7896.881546776803;7905.604719763989;7936.127026027248;8055.154208808108;8063.516189028677;5881.323647780475;6411.871762564722;6720.428763555153;6775.728970841111;6845.828854278683;1846.8522518198513;1910.5002572980143;1956.7224898295299;1961.794011628787;1969.714391413237;931.487681775021;1057.0486562094177;1063.3035361838008;1087.7878813631266;1100.6697990602788;20391.286304979254;21018.894905525376;21115.683264751042;21121.155153793985;21166.78833211648;1003.9096481316717;1012.6202673997251;1014.9492525373702;1023.2683631203726;1083.111848284415;11476.713082173012;11686.649400517997;11956.880431195577;12031.217970831867;12055.336956467478;499000;506129;509072;512149;516893;83189;84293.57853210818;84394;85358.5732071348;86922;1024.6925922223304;1027.7173777211326;1037.227265687083;1047.7747284333905;1047.8271085270997;18317.175727092046;18464.630707386044;18842.811571884107;18990.905045475236;19089;40240.396394053525;41500.169996599296;41520;42090;43911.78044109759;60135.69932150311;62056.68971655294;62738.37261627326;63183;64319.35680643134;7244.927550724426;7700.499467534592;7950.125486196629;7987.760367188994;8222.712205072794;9674.419534827934;13416.32918354098;13862;14223.359948802121;14673.779893301822;11236.460290179686;11537.48081336325;12152.696182595506;12263.93868030654;12627.431765570755;11946.2832230063;12055.879441205476;12330.321832299309;12427;12503.499860005499;12265.38673066361;12607.243565386107;12747.362631868555;12767.489300427878;13184.274864882524;8645.438046526955;8769.030099668547;8812.691555795516;8830.779230519289;8945.15021072997;8694.130586941255;12136;12240.265584064984;12359.32023738703;12365.196262243286 11:09:14 INFO - PROCESS | 2751 | |3;mootools.html;1268.8984881209503;1423.1603354021127;1453.3169410377122;1567.2398886540034;1738.6348866737985;8339.583020848955;8711.128887111294;8718.869216961742;8921.598528066237;8936.553172341373;8645;8807.2513836324;8816.867746983784;8835.381523293372;8867.68963086292;1990.4625751047208;2225.721784776903;2287.954240915181;2288.622377307742;2322.814174866015;2308.284431826131;2309.2494939144763;2309.4341886237894;2310.803581695558;2319.373769082347;2284.132029828671;2287.1080278691325;2315.7915787579113;2317.24689475921;2318.188633978111;1917.1085445267947;2154.9461263468384;2219.312013275882;2226.5435585705054;2234.251525738863;2251.7297924249033;2260.1411463643876;2277.339571524256;2280.361498780344;2280.429892526868;8971.596278167499;8972.730818075468;9015.729528114167;9020.060686952336;9029.909700903037;5044.344235249431;5048.015636950796;5101.617378696613;5104.285400043997;5163.793448262065;3204.1829333520036;3313.188268874141;3337.3825842219267;3340.46552551593;3347.5313456116164;1145.9025982791472;1148.4717030166134;1184.8755880632496;1186.988130118705;1199.7960346741074;12225.694357641041;12284.815727764091;12298.200616959959;12337.75324493514;12375;4320.827166913288;4346.5653434656915;4532.524084971096;4538.048639085225;4541.591256786905;10083.243756718275;10145.9492702536;10147.137493313003;10152.898471015194;10158.644447444303;5120.718360490135;5140.7943682253035;5151.407588127338;5155.510226528474;5157.742112894341;4206.137741762931;4635.049814788028;4759.119562880878;4768.141734487756;4830.589399900978;3954.9011274718364;3979.542352629485;4058.5941405859176;4095.5904409558807;4118.588141185857;1119.5130118398522;1176.276589897207;1255.767682978652;1256.0579565326007;1256.7109564800148;746.9925300747032;889.3596610440472;959.712086374085;968.6851773173747;987.9407235565889;6034.456898879122;6072.423119803611;6084.4828189603495;6097.847553811191;6168.629882207082;983.1741337276721;984.4740651989388;999.2355847776457;1002.4035698759227;1005.1857995024054;4119.773412462283;4273.145370925828;4278.893027674333;4287.528371879091;4302.720323178984;11028.117750579935;11125.388103654377;11129.774045190994;11203.439828008566;11218.382988935688;11053.060489858452;11070.944645276883;11071.114310855111;11074.889251107546;11075.11399088071;7909.406794490321;8216.137305582948;8244.8351032979;8446.873296900674;8456.069832318562;6064.696765161812;6175.320714721467;6287.339829317856;6310.463610593151;6476;10155.441450720282;10320.9999999997;10600.204984626029;10653.041226289672;10759.193060520336;10728;10743.623973160902;10784.029437350677;10861.642294713161;10887.945560272148;7243.7464688735645;7303.780886573411;7455.366293865082;7474.289942455458;7706.576138312446;8166.7958301042945;8387.454815436977;8561.1866872647;8626.137386261324;8903.109689031045;7637.9688742021335;7817.921820781947;7899.921000789918;7914.762557123296;7934.64294106755;7670.348020418327;7752.0697516298405;7766.378689704697;7810.218978102144;7970.202979702215;7297.1973082961895;7335.046443962251;7357.484976051625;7359.558426494427;7366.558006519626;5091.9490805092955;5093.745312734422;5294.100002999422;5475.260839786737;5481.780728770805;5144.151215049475;5283.682979021271;5314.256004159498;5479.205515200194;5513.61404701667 11:09:14 INFO - PROCESS | 2751 | |4;prototype.html;312.4235784976717;326.5053444032291;327.3567439980438;327.8229755931797;335.9949600755988;5293.15309550472;5347.973260133704;5352.330958630171;5374.381946076202;5381.327334083239;4967.379077615298;5041.974790126053;5189.169732842746;5200.661956972804;5253.159494480884;4136.58634136587;4151.315033019563;4152.3183110840155;4164.708470407073;4168.24971505129;4136.296829538971;4151.045259590281;4152.086540960984;4170.249355116078;4178.266019601861;3943.1127996200767;3995.2808494470983;4121.835126594932;4143.233501802161;4144.647704945083;4107;4119.752814831119;4127.463429754112;4138.461999940018;4151.750894946298;3667.541557305337;3679.8344074516713;3684.907877303062;3685.281370132825;3685.8894233173046;4981.476944920767;5059.569936555397;5079.4412614612365;5096.566791822699;5144.202648589438;4727.66906316558;4729.881752956169;4737.692050016773;4743.501932297094;4751.334813126131;5480.945190548084;5492.890142197134;5502.972485137589;5504.256925315071;5504.4770746779395;3900.4734360861203;4048.9595104048876;4065.6137666921595;4072.877813665565;4074.633283004544;5691.264164429847;5708.315002199721;5713.3429655589725;5730.9140362895005;5733.684647344395;4159.563245859202;4164.312888373445;4169.791510424467;4172.895677608084;4211.136716973013;4090.4477895484324;4199.160167966419;4201.516825565038;4228.873133805991;4262.957370426318;4691.366665500182;4708.788104535304;4711.361637483021;4713.57577817998;4736.715797052188;5482.7115627827425;5489.84334007947;5528.585356098309;5529.645236916981;5537.916931246034;1333.8399392073013;1414.9246572604895;1428.350100704177;1437.6046587188607;1458.358322338168;904.7692838326185;907.2061945797427;913.5980168725739;923.1091996223543;927.7402327348353;4700.50873037284;4716;4752.2633991730645;4769.998300356894;4806.975965120152;4928.334674818925;4943.826966056171;4957.132501812169;5002.199648056367;5011.922436676132;4662.552160115898;4730.929036064462;4739.194336962724;4817.771468275568;4860.854174374775;2722.931926701848;2730.726927307293;2731.289864635209;2736.38431352944;2752.477029364414;5256;5256.662019617494;5308.522232998971;5315.415304316522;5326;4779.593734532534;5064.82273120439;5085.949140508547;5091.759625764652;5146.356705411824;5175.136950697746;5186.740662966837;5194.246834209094;5194.662346947436;5215.878586104006;5008.398992120969;5016.846125391107;5019.698818070928;5020.949790502048;5072.923906141337;4636.794433447395;4962.230854217602;4984.031307633392;4986.775595098156;4999.500049994971;5113.590912726899;5164.586833053422;5168.043911876315;5177.249298851721;5187.507186817246;3699.352613292717;3712.9046931154835;3715.3126671565847;3847.4228865670375;3893.785841778616;5612.382637909908;5626.690532020778;5632.7183640816975;5636.520895723909;5679.8864022720145;5470.17947307907;5482.479164479368;5493.505584497414;5515.283013208257;5526.281583394133;5331.600129990189;5470.835874923759;5472.179173124063;5487.890242195213;5495.422980586981;5415.864603384947;5422.674639521641;5434.130539113723;5434.804343044524;5437.184422336682;5355.571554275726;5477.972610136924;5498.367687715964;5500.367457742251;5529.198266251451;5376.381716102542;5422.8373148805595;5424.945750542444;5429.891402172014;5431.728413579226 11:09:14 INFO - PROCESS | 2751 | |5;yui.html;719.8920161975703;732.2567593892197;760.7565579014714;779.9610019499023;812.0904586862715;14781.704365912688;15844;15869.68260634788;15872.444464443732;16586.751198732;15452.304646290915;16303.918480407581;16326.673466530663;16347.182640867968;16356.34574617017;653.2096163641999;781.1719577248107;805.6253841963486;807.8909347238135;807.9272865442109;781.613101514751;805.8630032894422;809.247399918076;818.5129847740585;818.5907046476761;850.8723691446271;851.5018714052287;854.0349405172178;854.1842540373959;854.9914500855006;679.6839469646638;697.7209116353448;848.4357901995165;849.464837152593;849.647396330522;508.5372311196793;596.6181643748005;609.0438012320658;609.4575827513517;616.3774587666444;15160.848391516054;15162.545123646309;15163.696726065416;15168.31742571587;15202.315895784715;13771.586852394445;14172.57482275523;14261.28693565328;14275.714485710332;14448.927755361156;12602.495900163982;12633.431495582721;12935.417906194243;12967.740645187043;13298.468061277537;4393.209222339978;4445.555444455561;4447.977760111179;4472.910541789146;4481.484629267643;75391.62304188444;76645.61677191578;78686.21313786846;79488.60255698685;80514;11268.211225214156;11320.37737924422;11397.487113079766;11627.88372116268;11642.65072047823;20059;20518;20551.4862128448;20610.58778824445;20649.587008260052;8465.915340846635;8731.563421828883;8768.868466973001;8789.165029322205;8891.4665120093;4513;4604.332371806069;4614.815407383667;4643.187442197669;4676.415448068991;3399.3031428557088;3521.1373213562842;3524.3656141894194;3524.859005639797;3526.3828829954655;602.7046747093892;618.35073173168;621.5711159300159;626.2485017978444;640.7276907314373;658.9868202636017;673.5689158938284;691.9204291506542;693.8092024693149;748.7753673897809;9548.856767148498;9980.201583873273;10021.148202402732;10054;10182.643607473703;572.9742161602654;579.2238400543208;611.8623309755269;701.5790525684548;732.0666150657847;4520.909581808345;4741.5258474153;4757.904841903142;4760.595349395271;4773.188557945157;69994.9500757489;90329.54835225781;95416;95428.52285738527;108724;94830.5258473717;94915;96271.22372657663;97113.51443242739;97447;54925.725371373686;82401.58799205965;82673.58663206645;84977.57511212528;85389;9732.70801875945;9740.794126595547;9765.918956228754;9784.657536986171;9947.303688741718;48700.26949595688;49184.508154917996;50313.24530132124;50405.49594504008;51204.231936520235;63728;68757.65621171863;70523;71169.28830711833;71412.28587714056;12551.497940082294;12616.306103164414;12655.240685558896;12770.489180432678;13245.735085298433;13405.66485837862;13738.519151830038;13817.516386926409;14015.649608759455;14833.777493337824;14214.573562793134;14290.35693393779;14415.207163606103;14618;14728.77906831377;13479.32603369808;13789.241591712553;14689.41242350294;14780.778288325899;15061.472848450252;13140.34298285101;13461.932690336485;13735.381907813973;13759.587212383645;14493.985421020427;10775.353478791298;11211.71970700739;11304.604338848101;11318.407960199005;11575.189736718687;10920.617778377718;11254.437278136224;11408.543658253577;11568;11664.591739289084 11:09:14 INFO - PROCESS | 2751 | __end_tp_report 11:09:14 INFO - PROCESS | 2751 | __start_cc_report 11:09:14 INFO - PROCESS | 2751 | _x_x_mozilla_cycle_collect,1121 11:09:14 INFO - PROCESS | 2751 | __end_cc_report 11:09:14 INFO - PROCESS | 2751 | __startTimestamp1467742154759__endTimestamp 11:09:14 INFO - PROCESS | 2751 | 11:09:14 INFO - PROCESS | 2751 | ------- Summary: start ------- 11:09:14 INFO - PROCESS | 2751 | Number of tests: 6 11:09:14 INFO - PROCESS | 2751 | 11:09:14 INFO - PROCESS | 2751 | [#0] dojo.html Cycles:165 Average:5205.46 Median:5349.04 stddev:582.00 (10.9%) stddev-sans-first:560.19 11:09:14 INFO - PROCESS | 2751 | Values: 3114.1 3138.8 3162.3 3163.8 3175.7 5181.7 5247.9 5261.3 5368.8 5386.0 5249.0 5257.2 5279.5 5300.3 5335.2 4728.4 4762.1 4796.4 4802.6 4926.8 4893.0 4934.5 4934.8 4943.9 4959.1 4648.2 4683.7 4759.3 4799.0 4819.3 4711.8 4729.5 4744.1 4782.5 4868.8 4721.0 4747.8 4751.9 4789.6 4814.4 5084.1 5149.7 5195.9 5220.3 5277.3 5509.8 5554.8 5569.7 5583.2 5594.1 5569.9 5585.2 5609.7 5622.5 5638.2 5042.4 5172.9 5190.3 5193.8 5207.3 5622.1 5681.5 5697.0 5706.7 5710.1 5439.7 5489.1 5533.4 5543.2 5547.0 5474.3 5591.9 5625.0 5651.7 5709.3 5648.1 5654.3 5671.1 5671.3 5683.0 5342.2 5676.5 5685.5 5701.2 5701.4 4188.7 4222.1 4242.9 4250.7 4259.5 3823.9 3829.2 3840.3 3853.4 3867.5 5105.9 5252.3 5255.0 5258.8 5301.7 5680.1 5686.6 5708.6 5754.9 5761.4 5346.9 5382.4 5386.1 5386.4 5388.5 4623.3 4700.7 4765.1 4770.7 4805.1 5835.1 5886.3 5913.4 5916.3 5960.5 5630.5 5635.7 5643.7 5646.2 5668.9 5714.7 5753.9 5791.1 5869.4 5882.9 5530.1 5539.6 5545.0 5547.4 5587.9 5629.0 5639.4 5641.1 5644.1 5644.7 5289.4 5354.5 5355.7 5368.4 5449.4 5346.1 5349.0 5356.3 5382.0 5383.9 5294.2 5296.5 5317.0 5339.3 5364.9 5210.7 5296.9 5470.3 5524.5 5537.1 5151.5 5318.7 5331.4 5333.2 5383.0 11:09:14 INFO - PROCESS | 2751 | 11:09:14 INFO - PROCESS | 2751 | [#1] ext.html Cycles:180 Average:60254.81 Median:37969.81 stddev:115296.60 (303.7%) stddev-sans-first:115532.99 11:09:14 INFO - PROCESS | 2751 | Values: 585.1 610.5 613.7 629.7 636.5 41279.6 41468.8 42327.0 42425.2 45481.3 43221.2 43720.1 43812.6 43819.3 43840.0 8169.6 9018.7 9201.1 10713.8 11021.6 10596.3 11006.3 11015.3 11020.1 11021.4 11011.9 11060.0 11066.7 11075.3 11077.3 10910.9 10961.7 10973.4 10990.1 10997.4 10910.2 10955.8 10957.6 10970.1 10972.7 43090.4 43305.4 43355.8 43428.8 43444.6 3588.1 3637.8 3690.9 3757.0 4004.6 33200.0 33623.0 34312.1 34525.0 34587.0 4408.3 4408.8 4442.7 4503.8 4616.0 345656.0 348971.0 349135.0 349196.0 350363.0 62705.7 62834.7 63143.0 63203.0 63334.0 66110.0 66159.0 66322.7 66366.7 66394.3 17036.0 17496.1 17511.7 17513.9 17528.1 12154.9 12156.8 12168.9 12172.3 12200.9 19142.1 19983.3 20035.6 20110.5 20143.0 7104.1 7198.4 7305.3 7321.9 7452.9 1008.7 1027.6 1101.3 1127.2 1181.1 32384.0 32425.4 32578.8 33008.8 33053.3 1116.2 1119.4 1134.6 1188.5 1211.5 17044.6 17127.0 17196.4 17198.5 17549.0 530305.0 534993.0 536283.0 538083.0 538952.0 55638.7 56079.4 56084.7 56146.0 56209.0 1206.3 1286.8 1328.5 1356.1 1364.4 31937.4 33695.2 34027.0 34033.8 34194.1 49308.3 49867.8 49919.8 49985.8 49999.0 400492.0 401943.0 402544.0 403909.0 404091.0 38078.6 41590.4 41950.8 43069.8 43552.0 46159.5 46555.3 46892.3 47779.0 48186.5 40063.8 40625.6 40895.8 41421.6 41551.4 40302.8 40306.0 40870.6 40910.2 41001.4 40603.6 41182.4 41185.4 41340.2 42239.8 35659.0 37335.4 37344.4 37780.2 37861.0 27963.7 28097.3 28244.3 28629.7 28885.4 11:09:14 INFO - PROCESS | 2751 | 11:09:14 INFO - PROCESS | 2751 | [#2] jquery.html Cycles:180 Average:29960.35 Median:13769.45 stddev:83670.10 (607.7%) stddev-sans-first:83875.35 11:09:14 INFO - PROCESS | 2751 | Values: 387.4 392.1 394.4 400.5 419.8 13595.8 19123.4 20720.8 20742.7 21295.4 15080.4 19670.9 19717.0 19998.9 20636.9 5746.3 5891.4 5904.1 5904.9 5927.9 5873.3 5902.4 5903.3 5904.1 5914.3 4112.9 4153.8 6484.6 6531.8 6647.3 6440.6 6575.3 6627.9 6638.7 6647.9 5673.9 5751.3 5778.0 5796.0 5799.0 23536.8 24192.6 25078.9 25176.9 25244.0 2452.6 2460.0 2517.2 2756.3 2887.6 13732.3 14365.1 14418.5 14699.5 14947.6 1935.7 1977.3 1989.8 2028.8 2064.7 83061.0 84407.0 85260.1 85692.6 85860.0 10523.7 10831.5 10959.3 11084.1 11259.8 15287.5 15406.0 15409.5 15445.3 15445.8 8183.7 8206.9 8296.8 8361.2 8382.7 7896.9 7905.6 7936.1 8055.2 8063.5 5881.3 6411.9 6720.4 6775.7 6845.8 1846.9 1910.5 1956.7 1961.8 1969.7 931.5 1057.0 1063.3 1087.8 1100.7 20391.3 21018.9 21115.7 21121.2 21166.8 1003.9 1012.6 1014.9 1023.3 1083.1 11476.7 11686.6 11956.9 12031.2 12055.3 499000.0 506129.0 509072.0 512149.0 516893.0 83189.0 84293.6 84394.0 85358.6 86922.0 1024.7 1027.7 1037.2 1047.8 1047.8 18317.2 18464.6 18842.8 18990.9 19089.0 40240.4 41500.2 41520.0 42090.0 43911.8 60135.7 62056.7 62738.4 63183.0 64319.4 7244.9 7700.5 7950.1 7987.8 8222.7 9674.4 13416.3 13862.0 14223.4 14673.8 11236.5 11537.5 12152.7 12263.9 12627.4 11946.3 12055.9 12330.3 12427.0 12503.5 12265.4 12607.2 12747.4 12767.5 13184.3 8645.4 8769.0 8812.7 8830.8 8945.2 8694.1 12136.0 12240.3 12359.3 12365.2 11:09:14 INFO - PROCESS | 2751 | 11:09:14 INFO - PROCESS | 2751 | [#3] mootools.html Cycles:180 Average:5851.02 Median:4535.29 stddev:3371.12 (74.3%) stddev-sans-first:3362.98 11:09:14 INFO - PROCESS | 2751 | Values: 1268.9 1423.2 1453.3 1567.2 1738.6 8339.6 8711.1 8718.9 8921.6 8936.6 8645.0 8807.3 8816.9 8835.4 8867.7 1990.5 2225.7 2288.0 2288.6 2322.8 2308.3 2309.2 2309.4 2310.8 2319.4 2284.1 2287.1 2315.8 2317.2 2318.2 1917.1 2154.9 2219.3 2226.5 2234.3 2251.7 2260.1 2277.3 2280.4 2280.4 8971.6 8972.7 9015.7 9020.1 9029.9 5044.3 5048.0 5101.6 5104.3 5163.8 3204.2 3313.2 3337.4 3340.5 3347.5 1145.9 1148.5 1184.9 1187.0 1199.8 12225.7 12284.8 12298.2 12337.8 12375.0 4320.8 4346.6 4532.5 4538.0 4541.6 10083.2 10145.9 10147.1 10152.9 10158.6 5120.7 5140.8 5151.4 5155.5 5157.7 4206.1 4635.0 4759.1 4768.1 4830.6 3954.9 3979.5 4058.6 4095.6 4118.6 1119.5 1176.3 1255.8 1256.1 1256.7 747.0 889.4 959.7 968.7 987.9 6034.5 6072.4 6084.5 6097.8 6168.6 983.2 984.5 999.2 1002.4 1005.2 4119.8 4273.1 4278.9 4287.5 4302.7 11028.1 11125.4 11129.8 11203.4 11218.4 11053.1 11070.9 11071.1 11074.9 11075.1 7909.4 8216.1 8244.8 8446.9 8456.1 6064.7 6175.3 6287.3 6310.5 6476.0 10155.4 10321.0 10600.2 10653.0 10759.2 10728.0 10743.6 10784.0 10861.6 10887.9 7243.7 7303.8 7455.4 7474.3 7706.6 8166.8 8387.5 8561.2 8626.1 8903.1 7638.0 7817.9 7899.9 7914.8 7934.6 7670.3 7752.1 7766.4 7810.2 7970.2 7297.2 7335.0 7357.5 7359.6 7366.6 5091.9 5093.7 5294.1 5475.3 5481.8 5144.2 5283.7 5314.3 5479.2 5513.6 11:09:14 INFO - PROCESS | 2751 | 11:09:14 INFO - PROCESS | 2751 | [#4] prototype.html Cycles:180 Average:4486.07 Median:5000.85 stddev:1280.45 (25.6%) stddev-sans-first:1245.13 11:09:14 INFO - PROCESS | 2751 | Values: 312.4 326.5 327.4 327.8 336.0 5293.2 5348.0 5352.3 5374.4 5381.3 4967.4 5042.0 5189.2 5200.7 5253.2 4136.6 4151.3 4152.3 4164.7 4168.2 4136.3 4151.0 4152.1 4170.2 4178.3 3943.1 3995.3 4121.8 4143.2 4144.6 4107.0 4119.8 4127.5 4138.5 4151.8 3667.5 3679.8 3684.9 3685.3 3685.9 4981.5 5059.6 5079.4 5096.6 5144.2 4727.7 4729.9 4737.7 4743.5 4751.3 5480.9 5492.9 5503.0 5504.3 5504.5 3900.5 4049.0 4065.6 4072.9 4074.6 5691.3 5708.3 5713.3 5730.9 5733.7 4159.6 4164.3 4169.8 4172.9 4211.1 4090.4 4199.2 4201.5 4228.9 4263.0 4691.4 4708.8 4711.4 4713.6 4736.7 5482.7 5489.8 5528.6 5529.6 5537.9 1333.8 1414.9 1428.4 1437.6 1458.4 904.8 907.2 913.6 923.1 927.7 4700.5 4716.0 4752.3 4770.0 4807.0 4928.3 4943.8 4957.1 5002.2 5011.9 4662.6 4730.9 4739.2 4817.8 4860.9 2722.9 2730.7 2731.3 2736.4 2752.5 5256.0 5256.7 5308.5 5315.4 5326.0 4779.6 5064.8 5085.9 5091.8 5146.4 5175.1 5186.7 5194.2 5194.7 5215.9 5008.4 5016.8 5019.7 5020.9 5072.9 4636.8 4962.2 4984.0 4986.8 4999.5 5113.6 5164.6 5168.0 5177.2 5187.5 3699.4 3712.9 3715.3 3847.4 3893.8 5612.4 5626.7 5632.7 5636.5 5679.9 5470.2 5482.5 5493.5 5515.3 5526.3 5331.6 5470.8 5472.2 5487.9 5495.4 5415.9 5422.7 5434.1 5434.8 5437.2 5355.6 5478.0 5498.4 5500.4 5529.2 5376.4 5422.8 5424.9 5429.9 5431.7 11:09:14 INFO - PROCESS | 2751 | 11:09:14 INFO - PROCESS | 2751 | [#5] yui.html Cycles:180 Average:19823.51 Median:4749.72 stddev:27239.00 (573.5%) stddev-sans-first:27277.65 11:09:14 INFO - PROCESS | 2751 | Values: 719.9 732.3 760.8 780.0 812.1 14781.7 15844.0 15869.7 15872.4 16586.8 15452.3 16303.9 16326.7 16347.2 16356.3 653.2 781.2 805.6 807.9 807.9 781.6 805.9 809.2 818.5 818.6 850.9 851.5 854.0 854.2 855.0 679.7 697.7 848.4 849.5 849.6 508.5 596.6 609.0 609.5 616.4 15160.8 15162.5 15163.7 15168.3 15202.3 13771.6 14172.6 14261.3 14275.7 14448.9 12602.5 12633.4 12935.4 12967.7 13298.5 4393.2 4445.6 4448.0 4472.9 4481.5 75391.6 76645.6 78686.2 79488.6 80514.0 11268.2 11320.4 11397.5 11627.9 11642.7 20059.0 20518.0 20551.5 20610.6 20649.6 8465.9 8731.6 8768.9 8789.2 8891.5 4513.0 4604.3 4614.8 4643.2 4676.4 3399.3 3521.1 3524.4 3524.9 3526.4 602.7 618.4 621.6 626.2 640.7 659.0 673.6 691.9 693.8 748.8 9548.9 9980.2 10021.1 10054.0 10182.6 573.0 579.2 611.9 701.6 732.1 4520.9 4741.5 4757.9 4760.6 4773.2 69995.0 90329.5 95416.0 95428.5 108724.0 94830.5 94915.0 96271.2 97113.5 97447.0 54925.7 82401.6 82673.6 84977.6 85389.0 9732.7 9740.8 9765.9 9784.7 9947.3 48700.3 49184.5 50313.2 50405.5 51204.2 63728.0 68757.7 70523.0 71169.3 71412.3 12551.5 12616.3 12655.2 12770.5 13245.7 13405.7 13738.5 13817.5 14015.6 14833.8 14214.6 14290.4 14415.2 14618.0 14728.8 13479.3 13789.2 14689.4 14780.8 15061.5 13140.3 13461.9 13735.4 13759.6 14494.0 10775.4 11211.7 11304.6 11318.4 11575.2 10920.6 11254.4 11408.5 11568.0 11664.6 11:09:14 INFO - PROCESS | 2751 | -------- Summary: end -------- 11:09:14 INFO - PROCESS | 2751 | 11:09:15 INFO - TEST-INFO | 2751: exit 0 11:09:15 INFO - TEST-OK | dromaeo_css | took 1114196ms 11:09:15 INFO - TEST-START | kraken 11:09:15 INFO - operating with platform_type : linux_ 11:09:15 INFO - Initialising browser for kraken test... 11:09:15 INFO - TEST-INFO | started process 3037 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpNiF1Dc/profile http://localhost:54629/getInfo.html) 11:09:19 INFO - PROCESS | 3037 | __metrics Screen width/height:1600/1200 11:09:19 INFO - PROCESS | 3037 | colorDepth:24 11:09:19 INFO - PROCESS | 3037 | Browser inner width/height: 1024/697 11:09:19 INFO - PROCESS | 3037 | __metrics 11:09:21 INFO - PROCESS | 3037 | JavaScript error: resource://app/modules/CaptivePortalWatcher.jsm, line 60: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 11:09:21 INFO - TEST-INFO | 3037: exit 0 11:09:21 INFO - Browser initialized. 11:09:21 INFO - Running cycle 1/1 for kraken test... 11:09:21 INFO - TEST-INFO | started process 3120 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpNiF1Dc/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 11:09:33 INFO - PROCESS | 3120 | RSS: Main: 156753920 11:09:33 INFO - PROCESS | 3120 | 11:09:36 INFO - PROCESS | 3120 | Cycle 1(1): loaded http://localhost:54629/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:54629/tests/kraken/driver.html?testName=audio-beat-detection) 11:09:36 INFO - PROCESS | 3120 | RSS: Main: 215699456 11:09:36 INFO - PROCESS | 3120 | 11:09:39 INFO - PROCESS | 3120 | Cycle 1(1): loaded http://localhost:54629/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:54629/tests/kraken/driver.html?testName=audio-dft) 11:09:40 INFO - PROCESS | 3120 | RSS: Main: 203395072 11:09:40 INFO - PROCESS | 3120 | 11:09:43 INFO - PROCESS | 3120 | Cycle 1(1): loaded http://localhost:54629/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:54629/tests/kraken/driver.html?testName=audio-fft) 11:09:43 INFO - PROCESS | 3120 | RSS: Main: 269201408 11:09:43 INFO - PROCESS | 3120 | 11:09:45 INFO - PROCESS | 3120 | Cycle 1(1): loaded http://localhost:54629/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:54629/tests/kraken/driver.html?testName=audio-oscillator) 11:09:46 INFO - PROCESS | 3120 | RSS: Main: 180441088 11:09:46 INFO - PROCESS | 3120 | 11:09:48 INFO - PROCESS | 3120 | Cycle 1(1): loaded http://localhost:54629/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:54629/tests/kraken/driver.html?testName=imaging-gaussian-blur) 11:09:49 INFO - PROCESS | 3120 | RSS: Main: 184000512 11:09:49 INFO - PROCESS | 3120 | 11:09:52 INFO - PROCESS | 3120 | Cycle 1(1): loaded http://localhost:54629/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:54629/tests/kraken/driver.html?testName=imaging-darkroom) 11:09:52 INFO - PROCESS | 3120 | RSS: Main: 218730496 11:09:52 INFO - PROCESS | 3120 | 11:09:56 INFO - PROCESS | 3120 | Cycle 1(1): loaded http://localhost:54629/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:54629/tests/kraken/driver.html?testName=imaging-desaturate) 11:09:56 INFO - PROCESS | 3120 | RSS: Main: 220770304 11:09:56 INFO - PROCESS | 3120 | 11:09:59 INFO - PROCESS | 3120 | Cycle 1(1): loaded http://localhost:54629/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:54629/tests/kraken/driver.html?testName=json-parse-financial) 11:10:00 INFO - PROCESS | 3120 | RSS: Main: 221097984 11:10:00 INFO - PROCESS | 3120 | 11:10:01 INFO - PROCESS | 3120 | Cycle 1(1): loaded http://localhost:54629/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:54629/tests/kraken/driver.html?testName=json-stringify-tinderbox) 11:10:02 INFO - PROCESS | 3120 | RSS: Main: 208785408 11:10:02 INFO - PROCESS | 3120 | 11:10:04 INFO - PROCESS | 3120 | Cycle 1(1): loaded http://localhost:54629/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:54629/tests/kraken/driver.html?testName=stanford-crypto-aes) 11:10:04 INFO - PROCESS | 3120 | RSS: Main: 212475904 11:10:04 INFO - PROCESS | 3120 | 11:10:06 INFO - PROCESS | 3120 | Cycle 1(1): loaded http://localhost:54629/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:54629/tests/kraken/driver.html?testName=stanford-crypto-ccm) 11:10:07 INFO - PROCESS | 3120 | RSS: Main: 211423232 11:10:07 INFO - PROCESS | 3120 | 11:10:10 INFO - PROCESS | 3120 | Cycle 1(1): loaded http://localhost:54629/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:54629/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 11:10:10 INFO - PROCESS | 3120 | RSS: Main: 225595392 11:10:10 INFO - PROCESS | 3120 | 11:10:13 INFO - PROCESS | 3120 | Cycle 1(1): loaded http://localhost:54629/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:54629/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 11:10:13 INFO - PROCESS | 3120 | RSS: Main: 224202752 11:10:13 INFO - PROCESS | 3120 | 11:10:15 INFO - PROCESS | 3120 | Cycle 1(1): loaded http://localhost:54629/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:54629/tests/kraken/driver.html?testName=ai-astar) 11:10:15 INFO - PROCESS | 3120 | RSS: Main: 266432512 11:10:15 INFO - PROCESS | 3120 | 11:10:15 INFO - PROCESS | 3120 | __start_tp_report 11:10:15 INFO - PROCESS | 3120 | _x_x_mozilla_page_load 11:10:15 INFO - PROCESS | 3120 | _x_x_mozilla_page_load_details 11:10:15 INFO - PROCESS | 3120 | |i|pagename|runs| 11:10:15 INFO - PROCESS | 3120 | |0;ai-astar;104;111;111;112;111;112;111;111;109;111 11:10:15 INFO - PROCESS | 3120 | |1;audio-beat-detection;153;114;118;178;116;123;142;120;145;115 11:10:15 INFO - PROCESS | 3120 | |2;audio-dft;161;162;160;160;163;162;160;161;161;163 11:10:15 INFO - PROCESS | 3120 | |3;audio-fft;73;75;77;108;75;75;74;75;105;74 11:10:15 INFO - PROCESS | 3120 | |4;audio-oscillator;84;84;114;83;84;84;118;84;84;136 11:10:15 INFO - PROCESS | 3120 | |5;imaging-gaussian-blur;116;117;116;116;117;116;117;116;119;117 11:10:15 INFO - PROCESS | 3120 | |6;imaging-darkroom;146;145;146;145;145;146;146;146;145;146 11:10:15 INFO - PROCESS | 3120 | |7;imaging-desaturate;95;95;95;95;95;95;96;95;96;95 11:10:15 INFO - PROCESS | 3120 | |8;json-parse-financial;54;55;56;54;63;54;57;56;56;55 11:10:15 INFO - PROCESS | 3120 | |9;json-stringify-tinderbox;62;63;61;62;63;62;63;62;63;64 11:10:15 INFO - PROCESS | 3120 | |10;stanford-crypto-aes;75;74;76;75;80;74;79;75;75;78 11:10:15 INFO - PROCESS | 3120 | |11;stanford-crypto-ccm;122;124;119;128;120;123;120;144;168;118 11:10:15 INFO - PROCESS | 3120 | |12;stanford-crypto-pbkdf2;162;162;163;157;155;162;159;158;157;159 11:10:15 INFO - PROCESS | 3120 | |13;stanford-crypto-sha256-iterative;67;62;63;62;62;68;62;63;61;61 11:10:15 INFO - PROCESS | 3120 | __end_tp_report 11:10:15 INFO - PROCESS | 3120 | __start_cc_report 11:10:15 INFO - PROCESS | 3120 | _x_x_mozilla_cycle_collect,1633 11:10:15 INFO - PROCESS | 3120 | __end_cc_report 11:10:15 INFO - PROCESS | 3120 | __startTimestamp1467742215836__endTimestamp 11:10:15 INFO - PROCESS | 3120 | 11:10:15 INFO - PROCESS | 3120 | ------- Summary: start ------- 11:10:15 INFO - PROCESS | 3120 | Number of tests: 14 11:10:15 INFO - PROCESS | 3120 | 11:10:15 INFO - PROCESS | 3120 | [#0] ai-astar Cycles:10 Average:110.30 Median:111.00 stddev:2.36 (2.1%) stddev-sans-first:0.87 11:10:15 INFO - PROCESS | 3120 | Values: 104.0 111.0 111.0 112.0 111.0 112.0 111.0 111.0 109.0 111.0 11:10:15 INFO - PROCESS | 3120 | 11:10:15 INFO - PROCESS | 3120 | [#1] audio-beat-detection Cycles:10 Average:132.40 Median:132.50 stddev:21.38 (16.1%) stddev-sans-first:21.34 11:10:15 INFO - PROCESS | 3120 | Values: 153.0 114.0 118.0 178.0 116.0 123.0 142.0 120.0 145.0 115.0 11:10:15 INFO - PROCESS | 3120 | 11:10:15 INFO - PROCESS | 3120 | [#2] audio-dft Cycles:10 Average:161.30 Median:161.50 stddev:1.16 (0.7%) stddev-sans-first:1.22 11:10:15 INFO - PROCESS | 3120 | Values: 161.0 162.0 160.0 160.0 163.0 162.0 160.0 161.0 161.0 163.0 11:10:15 INFO - PROCESS | 3120 | 11:10:15 INFO - PROCESS | 3120 | [#3] audio-fft Cycles:10 Average:81.10 Median:75.00 stddev:13.44 (17.9%) stddev-sans-first:13.94 11:10:15 INFO - PROCESS | 3120 | Values: 73.0 75.0 77.0 108.0 75.0 75.0 74.0 75.0 105.0 74.0 11:10:15 INFO - PROCESS | 3120 | 11:10:15 INFO - PROCESS | 3120 | [#4] audio-oscillator Cycles:10 Average:95.50 Median:84.00 stddev:19.55 (23.3%) stddev-sans-first:20.28 11:10:15 INFO - PROCESS | 3120 | Values: 84.0 84.0 114.0 83.0 84.0 84.0 118.0 84.0 84.0 136.0 11:10:15 INFO - PROCESS | 3120 | 11:10:15 INFO - PROCESS | 3120 | [#5] imaging-gaussian-blur Cycles:10 Average:116.70 Median:117.00 stddev:0.95 (0.8%) stddev-sans-first:0.97 11:10:15 INFO - PROCESS | 3120 | Values: 116.0 117.0 116.0 116.0 117.0 116.0 117.0 116.0 119.0 117.0 11:10:15 INFO - PROCESS | 3120 | 11:10:15 INFO - PROCESS | 3120 | [#6] imaging-darkroom Cycles:10 Average:145.60 Median:146.00 stddev:0.52 (0.4%) stddev-sans-first:0.53 11:10:15 INFO - PROCESS | 3120 | Values: 146.0 145.0 146.0 145.0 145.0 146.0 146.0 146.0 145.0 146.0 11:10:15 INFO - PROCESS | 3120 | 11:10:15 INFO - PROCESS | 3120 | [#7] imaging-desaturate Cycles:10 Average:95.20 Median:95.00 stddev:0.42 (0.4%) stddev-sans-first:0.44 11:10:15 INFO - PROCESS | 3120 | Values: 95.0 95.0 95.0 95.0 95.0 95.0 96.0 95.0 96.0 95.0 11:10:15 INFO - PROCESS | 3120 | 11:10:15 INFO - PROCESS | 3120 | [#8] json-parse-financial Cycles:10 Average:56.00 Median:56.00 stddev:2.67 (4.8%) stddev-sans-first:2.73 11:10:15 INFO - PROCESS | 3120 | Values: 54.0 55.0 56.0 54.0 63.0 54.0 57.0 56.0 56.0 55.0 11:10:15 INFO - PROCESS | 3120 | 11:10:15 INFO - PROCESS | 3120 | [#9] json-stringify-tinderbox Cycles:10 Average:62.50 Median:63.00 stddev:0.85 (1.3%) stddev-sans-first:0.88 11:10:15 INFO - PROCESS | 3120 | Values: 62.0 63.0 61.0 62.0 63.0 62.0 63.0 62.0 63.0 64.0 11:10:15 INFO - PROCESS | 3120 | 11:10:15 INFO - PROCESS | 3120 | [#10] stanford-crypto-aes Cycles:10 Average:76.10 Median:75.50 stddev:2.13 (2.8%) stddev-sans-first:2.22 11:10:15 INFO - PROCESS | 3120 | Values: 75.0 74.0 76.0 75.0 80.0 74.0 79.0 75.0 75.0 78.0 11:10:15 INFO - PROCESS | 3120 | 11:10:15 INFO - PROCESS | 3120 | [#11] stanford-crypto-ccm Cycles:10 Average:128.60 Median:123.50 stddev:15.77 (12.8%) stddev-sans-first:16.55 11:10:15 INFO - PROCESS | 3120 | Values: 122.0 124.0 119.0 128.0 120.0 123.0 120.0 144.0 168.0 118.0 11:10:15 INFO - PROCESS | 3120 | 11:10:15 INFO - PROCESS | 3120 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:159.40 Median:160.50 stddev:2.72 (1.7%) stddev-sans-first:2.71 11:10:15 INFO - PROCESS | 3120 | Values: 162.0 162.0 163.0 157.0 155.0 162.0 159.0 158.0 157.0 159.0 11:10:15 INFO - PROCESS | 3120 | 11:10:15 INFO - PROCESS | 3120 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:63.10 Median:62.50 stddev:2.42 (3.9%) stddev-sans-first:2.12 11:10:15 INFO - PROCESS | 3120 | Values: 67.0 62.0 63.0 62.0 62.0 68.0 62.0 63.0 61.0 61.0 11:10:15 INFO - PROCESS | 3120 | -------- Summary: end -------- 11:10:15 INFO - PROCESS | 3120 | 11:10:16 INFO - TEST-INFO | 3120: exit 0 11:10:16 INFO - TEST-OK | kraken | took 61334ms 11:10:16 INFO - SUITE-END | took 1175s 11:10:16 INFO - Completed test suite (00:19:35) 11:10:16 INFO - javascript benchmark 11:10:17 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"lowerIsBetter": false, "subtests": [{"name": "dojo.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [3114.128044147639, 3138.7802853800245, 3162.2884850908536, 3163.8101713897163, 3175.6983086606765, 5181.715005674687, 5247.947520524794, 5261.316028916241, 5368.812091576796, 5386.030514507392, 5249.028929648009, 5257.158854583267, 5279.524842764151, 5300.310959575259, 5335.1997200419955, 4728.408948881382, 4762.095201911643, 4796.4244290685165, 4802.567768900798, 4926.778294976734, 4892.975535122319, 4934.481879402665, 4934.753262336887, 4943.901121977577, 4959.082569724613, 4648.163330600491, 4683.672142949978, 4759.309900064472, 4799.016201678647, 4819.2771084337455, 4711.8350857719815, 4729.456112547066, 4744.122337367564, 4782.545658162504, 4868.756562171877, 4721.0, 4747.786349614275, 4751.904961900777, 4789.592884604813, 4814.374131362935, 5084.110280700863, 5149.665271757323, 5195.896082078375, 5220.347456567929, 5277.340332458442, 5509.779608815643, 5554.805581804618, 5569.66582005081, 5583.162525621149, 5594.13290939905, 5569.8607534811545, 5585.190147428641, 5609.719514024282, 5622.522085622727, 5638.210650508932, 5042.369703787027, 5172.948270517284, 5190.273361729323, 5193.844184674465, 5207.3490813648295, 5622.072358060874, 5681.460261275172, 5696.971515142398, 5706.657600543981, 5710.114932185435, 5439.700816455133, 5489.094299440628, 5533.391326954032, 5543.196236545678, 5547.0, 5474.315710536183, 5591.916121258185, 5625.043742563774, 5651.717414129359, 5709.25779648643, 5648.124540696199, 5654.321481422256, 5671.092625180034, 5671.262735844314, 5682.971585142131, 5342.198670199424, 5676.545876329884, 5685.5167310778215, 5701.2018317435595, 5701.372848986608, 4188.685848561309, 4222.113356195234, 4242.936355954663, 4250.681198910094, 4259.5101563319995, 3823.9044023899623, 3829.195868867513, 3840.251151025523, 3853.3641949078087, 3867.5165604299464, 5105.923411148836, 5252.290940722954, 5254.97372513135, 5258.8159414420315, 5301.734913254322, 5680.091185410314, 5686.630369026, 5708.600397972102, 5754.856128596735, 5761.423857614205, 5346.8663283417445, 5382.407935127133, 5386.111291636836, 5386.380566234933, 5388.54197393226, 4623.329617205486, 4700.7179569225955, 4765.142274390643, 4770.689905156223, 4805.087033463631, 5835.066389377679, 5886.293644762656, 5913.408659134052, 5916.349201587908, 5960.493358064527, 5630.493255607015, 5635.6618602883955, 5643.746031428677, 5646.153077038312, 5668.858278543069, 5714.685692286964, 5753.942460575341, 5791.131330300489, 5869.354371019099, 5882.882342353215, 5530.142827861688, 5539.584531160099, 5544.972275138599, 5547.362053363753, 5587.8882422352135, 5629.043062679436, 5639.407862174413, 5641.097424412074, 5644.068728659725, 5644.717764111861, 5289.444608316226, 5354.464553544614, 5355.651882627617, 5368.382635996911, 5449.426506597348, 5346.0644387231305, 5349.037173308841, 5356.330458692663, 5381.973090134525, 5383.946160538345, 5294.205869119509, 5296.523312901857, 5316.973415132899, 5339.252504649275, 5364.946350536601, 5210.687358758487, 5296.947030529799, 5470.261514695465, 5524.475174858382, 5537.1140617501005, 5151.5106064923775, 5318.7074710891275, 5331.3868905076415, 5333.226682131147, 5382.973085134549], "value": 5167.653443453619, "unit": "score"}, {"name": "ext.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [585.0843430031999, 610.5146408605159, 613.6502193749565, 629.7292164369319, 636.5448704176514, 41279.58720412795, 41468.79265603671, 42327.0, 42425.15149697008, 45481.31778023332, 43221.245662977046, 43720.12559748803, 43812.561874381325, 43819.342709859375, 43840.0, 8169.550674712888, 9018.68434604789, 9201.079892010812, 10713.78572428551, 11021.559137634486, 10596.258261921668, 11006.339619622848, 11015.339079655207, 11020.063294619928, 11021.44892755363, 11011.944940275287, 11060.0, 11066.667999960015, 11075.335479871193, 11077.335359878432, 10910.945445272762, 10961.671149865517, 10973.396463194522, 10990.065844403236, 10997.395143267117, 10910.23628346016, 10955.780884382268, 10957.56169753209, 10970.122390208844, 10972.670819875417, 43090.35364469535, 43305.35041974373, 43355.783221084006, 43428.78285608583, 43444.565554344365, 3588.1209103769743, 3637.7999210043436, 3690.9446358304376, 3756.9624303756887, 4004.599540046001, 33200.0, 33623.0, 34312.14219644504, 34525.0, 34587.0, 4408.25059739845, 4408.823647054114, 4442.666799990014, 4503.752293623849, 4615.976920115378, 345656.0, 348971.0, 349134.99999999744, 349196.0, 350363.0, 62705.68647156735, 62834.685826570574, 63143.0, 63203.0, 63334.0, 66110.0, 66159.0, 66322.66838665775, 66366.66816665886, 66394.33605663978, 17036.0, 17496.125193740263, 17511.73732394015, 17513.912430437766, 17528.12359382026, 12154.939225303993, 12156.756864862653, 12168.878311216951, 12172.330521821385, 12200.877991219973, 19142.138603762865, 19983.300584479475, 20035.599288014157, 20110.497237568885, 20143.0, 7104.147502299757, 7198.352148306678, 7305.305995930378, 7321.853562928818, 7452.85094298111, 1008.6620981971122, 1027.5581499954942, 1101.2896681640298, 1127.1884243344778, 1181.0964612071773, 32384.0, 32425.35149297048, 32578.83710581432, 33008.774496917154, 33053.3389332212, 1116.2242241642143, 1119.4290911634962, 1134.5631931706353, 1188.4592510407745, 1211.51539384247, 17044.573885652957, 17127.0, 17196.398126065527, 17198.484045478657, 17549.0, 530305.0, 534993.0, 536283.0, 538083.0, 538952.0, 55638.721806390706, 56079.439205608236, 56084.719576401854, 56146.0, 56209.0, 1206.258151236983, 1286.7619490394306, 1328.548293580168, 1356.1185229600642, 1364.4201214483805, 31937.361252775278, 33695.15762105967, 34027.0, 34033.829830850686, 34194.05049298327, 49308.26037609367, 49867.750661246464, 49919.75040124921, 49985.75007125086, 49999.0, 400492.0, 401943.0, 402543.9872800617, 403909.0, 404091.0, 38078.619213807506, 41590.376144358466, 41950.79024604857, 43069.784651076545, 43552.0, 46159.53840461552, 46555.30167047429, 46892.29661555147, 47779.0, 48186.5181348182, 40063.79968100141, 40625.59374406218, 40895.795521022206, 41421.585784142975, 41551.376729349686, 40302.798486007385, 40306.0, 40870.59129408668, 40910.18179636331, 41001.38497922474, 40603.59396405998, 41182.38226426666, 41185.38221926614, 41340.1731965353, 42239.788801055794, 35659.0, 37335.43996839995, 37344.43983340198, 37780.244395112495, 37861.0, 27963.720362796925, 28097.297567560974, 28244.293892652026, 28629.713702862704, 28885.42229155363], "value": 21099.18453329471, "unit": "score"}, {"name": "jquery.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [387.42080589518673, 392.10208622255044, 394.3532606525301, 400.51537639456257, 419.7565412061005, 13595.796063059062, 19123.42629721107, 20720.792792072058, 20742.688859667116, 21295.361139165812, 15080.396784128621, 19670.90164549175, 19717.0, 19998.90000549999, 20636.896815515902, 5746.281714785652, 5891.410858914117, 5904.084866845646, 5904.911426328608, 5927.911081333784, 5873.2658417697785, 5902.380250073745, 5903.291605007405, 5904.084866845646, 5914.349421563625, 4112.938305925413, 4153.792310384484, 6484.6433446160445, 6531.836704082389, 6647.302033286508, 6440.645764482952, 6575.342465753434, 6627.86744265112, 6638.701258443358, 6647.867042659144, 5673.914891276634, 5751.281089863767, 5778.0466223073145, 5796.0, 5799.043157878945, 23536.76463235363, 24192.637110443357, 25078.874605626854, 25176.874115629304, 25244.0, 2452.644366566838, 2460.015993602555, 2517.1567524879188, 2756.3109222694325, 2887.581300711406, 13732.313384330744, 14365.066270692372, 14418.495352662607, 14699.485518006819, 14947.551573452814, 1935.7289979402894, 1977.2980591889816, 1989.8408127349778, 2028.8275496582808, 2064.6593312103487, 83061.0, 84407.0, 85260.14739852583, 85692.57153714253, 85860.0, 10523.68453943257, 10831.458427078773, 10959.287646302964, 11084.057855082408, 11259.831102533468, 15287.464938727313, 15406.0, 15409.537713868602, 15445.30496127677, 15445.84554154444, 8183.672653093929, 8206.917930820735, 8296.792580185544, 8361.205685459872, 8382.748517544484, 7896.881546776803, 7905.604719763989, 7936.127026027248, 8055.154208808108, 8063.516189028677, 5881.323647780475, 6411.871762564722, 6720.428763555153, 6775.728970841111, 6845.828854278683, 1846.8522518198513, 1910.5002572980143, 1956.7224898295299, 1961.794011628787, 1969.714391413237, 931.487681775021, 1057.0486562094177, 1063.3035361838008, 1087.7878813631266, 1100.6697990602788, 20391.286304979254, 21018.894905525376, 21115.683264751042, 21121.155153793985, 21166.78833211648, 1003.9096481316717, 1012.6202673997251, 1014.9492525373702, 1023.2683631203726, 1083.111848284415, 11476.713082173012, 11686.649400517997, 11956.880431195577, 12031.217970831867, 12055.336956467478, 499000.0, 506129.0, 509072.0, 512149.0, 516893.0, 83189.0, 84293.57853210818, 84394.0, 85358.5732071348, 86922.0, 1024.6925922223304, 1027.7173777211326, 1037.227265687083, 1047.7747284333905, 1047.8271085270997, 18317.175727092046, 18464.630707386044, 18842.811571884107, 18990.905045475236, 19089.0, 40240.396394053525, 41500.169996599296, 41520.0, 42090.0, 43911.78044109759, 60135.69932150311, 62056.68971655294, 62738.37261627326, 63183.0, 64319.35680643134, 7244.927550724426, 7700.499467534592, 7950.125486196629, 7987.760367188994, 8222.712205072794, 9674.419534827934, 13416.32918354098, 13862.0, 14223.359948802121, 14673.779893301822, 11236.460290179686, 11537.48081336325, 12152.696182595506, 12263.93868030654, 12627.431765570755, 11946.2832230063, 12055.879441205476, 12330.321832299309, 12427.0, 12503.499860005499, 12265.38673066361, 12607.243565386107, 12747.362631868555, 12767.489300427878, 13184.274864882524, 8645.438046526955, 8769.030099668547, 8812.691555795516, 8830.779230519289, 8945.15021072997, 8694.130586941255, 12136.0, 12240.265584064984, 12359.32023738703, 12365.196262243286], "value": 9643.428240030846, "unit": "score"}, {"name": "mootools.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [1268.8984881209503, 1423.1603354021127, 1453.3169410377122, 1567.2398886540034, 1738.6348866737985, 8339.583020848955, 8711.128887111294, 8718.869216961742, 8921.598528066237, 8936.553172341373, 8645.0, 8807.2513836324, 8816.867746983784, 8835.381523293372, 8867.68963086292, 1990.4625751047208, 2225.721784776903, 2287.954240915181, 2288.622377307742, 2322.814174866015, 2308.284431826131, 2309.2494939144763, 2309.4341886237894, 2310.803581695558, 2319.373769082347, 2284.132029828671, 2287.1080278691325, 2315.7915787579113, 2317.24689475921, 2318.188633978111, 1917.1085445267947, 2154.9461263468384, 2219.312013275882, 2226.5435585705054, 2234.251525738863, 2251.7297924249033, 2260.1411463643876, 2277.339571524256, 2280.361498780344, 2280.429892526868, 8971.596278167499, 8972.730818075468, 9015.729528114167, 9020.060686952336, 9029.909700903037, 5044.344235249431, 5048.015636950796, 5101.617378696613, 5104.285400043997, 5163.793448262065, 3204.1829333520036, 3313.188268874141, 3337.3825842219267, 3340.46552551593, 3347.5313456116164, 1145.9025982791472, 1148.4717030166134, 1184.8755880632496, 1186.988130118705, 1199.7960346741074, 12225.694357641041, 12284.815727764091, 12298.200616959959, 12337.75324493514, 12375.0, 4320.827166913288, 4346.5653434656915, 4532.524084971096, 4538.048639085225, 4541.591256786905, 10083.243756718275, 10145.9492702536, 10147.137493313003, 10152.898471015194, 10158.644447444303, 5120.718360490135, 5140.7943682253035, 5151.407588127338, 5155.510226528474, 5157.742112894341, 4206.137741762931, 4635.049814788028, 4759.119562880878, 4768.141734487756, 4830.589399900978, 3954.9011274718364, 3979.542352629485, 4058.5941405859176, 4095.5904409558807, 4118.588141185857, 1119.5130118398522, 1176.276589897207, 1255.767682978652, 1256.0579565326007, 1256.7109564800148, 746.9925300747032, 889.3596610440472, 959.712086374085, 968.6851773173747, 987.9407235565889, 6034.456898879122, 6072.423119803611, 6084.4828189603495, 6097.847553811191, 6168.629882207082, 983.1741337276721, 984.4740651989388, 999.2355847776457, 1002.4035698759227, 1005.1857995024054, 4119.773412462283, 4273.145370925828, 4278.893027674333, 4287.528371879091, 4302.720323178984, 11028.117750579935, 11125.388103654377, 11129.774045190994, 11203.439828008566, 11218.382988935688, 11053.060489858452, 11070.944645276883, 11071.114310855111, 11074.889251107546, 11075.11399088071, 7909.406794490321, 8216.137305582948, 8244.8351032979, 8446.873296900674, 8456.069832318562, 6064.696765161812, 6175.320714721467, 6287.339829317856, 6310.463610593151, 6476.0, 10155.441450720282, 10320.9999999997, 10600.204984626029, 10653.041226289672, 10759.193060520336, 10728.0, 10743.623973160902, 10784.029437350677, 10861.642294713161, 10887.945560272148, 7243.7464688735645, 7303.780886573411, 7455.366293865082, 7474.289942455458, 7706.576138312446, 8166.7958301042945, 8387.454815436977, 8561.1866872647, 8626.137386261324, 8903.109689031045, 7637.9688742021335, 7817.921820781947, 7899.921000789918, 7914.762557123296, 7934.64294106755, 7670.348020418327, 7752.0697516298405, 7766.378689704697, 7810.218978102144, 7970.202979702215, 7297.1973082961895, 7335.046443962251, 7357.484976051625, 7359.558426494427, 7366.558006519626, 5091.9490805092955, 5093.745312734422, 5294.100002999422, 5475.260839786737, 5481.780728770805, 5144.151215049475, 5283.682979021271, 5314.256004159498, 5479.205515200194, 5513.61404701667], "value": 4647.554151125125, "unit": "score"}, {"name": "prototype.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [312.4235784976717, 326.5053444032291, 327.3567439980438, 327.8229755931797, 335.9949600755988, 5293.15309550472, 5347.973260133704, 5352.330958630171, 5374.381946076202, 5381.327334083239, 4967.379077615298, 5041.974790126053, 5189.169732842746, 5200.661956972804, 5253.159494480884, 4136.58634136587, 4151.315033019563, 4152.3183110840155, 4164.708470407073, 4168.24971505129, 4136.296829538971, 4151.045259590281, 4152.086540960984, 4170.249355116078, 4178.266019601861, 3943.1127996200767, 3995.2808494470983, 4121.835126594932, 4143.233501802161, 4144.647704945083, 4107.0, 4119.752814831119, 4127.463429754112, 4138.461999940018, 4151.750894946298, 3667.541557305337, 3679.8344074516713, 3684.907877303062, 3685.281370132825, 3685.8894233173046, 4981.476944920767, 5059.569936555397, 5079.4412614612365, 5096.566791822699, 5144.202648589438, 4727.66906316558, 4729.881752956169, 4737.692050016773, 4743.501932297094, 4751.334813126131, 5480.945190548084, 5492.890142197134, 5502.972485137589, 5504.256925315071, 5504.4770746779395, 3900.4734360861203, 4048.9595104048876, 4065.6137666921595, 4072.877813665565, 4074.633283004544, 5691.264164429847, 5708.315002199721, 5713.3429655589725, 5730.9140362895005, 5733.684647344395, 4159.563245859202, 4164.312888373445, 4169.791510424467, 4172.895677608084, 4211.136716973013, 4090.4477895484324, 4199.160167966419, 4201.516825565038, 4228.873133805991, 4262.957370426318, 4691.366665500182, 4708.788104535304, 4711.361637483021, 4713.57577817998, 4736.715797052188, 5482.7115627827425, 5489.84334007947, 5528.585356098309, 5529.645236916981, 5537.916931246034, 1333.8399392073013, 1414.9246572604895, 1428.350100704177, 1437.6046587188607, 1458.358322338168, 904.7692838326185, 907.2061945797427, 913.5980168725739, 923.1091996223543, 927.7402327348353, 4700.50873037284, 4716.0, 4752.2633991730645, 4769.998300356894, 4806.975965120152, 4928.334674818925, 4943.826966056171, 4957.132501812169, 5002.199648056367, 5011.922436676132, 4662.552160115898, 4730.929036064462, 4739.194336962724, 4817.771468275568, 4860.854174374775, 2722.931926701848, 2730.726927307293, 2731.289864635209, 2736.38431352944, 2752.477029364414, 5256.0, 5256.662019617494, 5308.522232998971, 5315.415304316522, 5326.0, 4779.593734532534, 5064.82273120439, 5085.949140508547, 5091.759625764652, 5146.356705411824, 5175.136950697746, 5186.740662966837, 5194.246834209094, 5194.662346947436, 5215.878586104006, 5008.398992120969, 5016.846125391107, 5019.698818070928, 5020.949790502048, 5072.923906141337, 4636.794433447395, 4962.230854217602, 4984.031307633392, 4986.775595098156, 4999.500049994971, 5113.590912726899, 5164.586833053422, 5168.043911876315, 5177.249298851721, 5187.507186817246, 3699.352613292717, 3712.9046931154835, 3715.3126671565847, 3847.4228865670375, 3893.785841778616, 5612.382637909908, 5626.690532020778, 5632.7183640816975, 5636.520895723909, 5679.8864022720145, 5470.17947307907, 5482.479164479368, 5493.505584497414, 5515.283013208257, 5526.281583394133, 5331.600129990189, 5470.835874923759, 5472.179173124063, 5487.890242195213, 5495.422980586981, 5415.864603384947, 5422.674639521641, 5434.130539113723, 5434.804343044524, 5437.184422336682, 5355.571554275726, 5477.972610136924, 5498.367687715964, 5500.367457742251, 5529.198266251451, 5376.381716102542, 5422.8373148805595, 5424.945750542444, 5429.891402172014, 5431.728413579226], "value": 4079.3440227882506, "unit": "score"}, {"name": "yui.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [719.8920161975703, 732.2567593892197, 760.7565579014714, 779.9610019499023, 812.0904586862715, 14781.704365912688, 15844.0, 15869.68260634788, 15872.444464443732, 16586.751198732, 15452.304646290915, 16303.918480407581, 16326.673466530663, 16347.182640867968, 16356.34574617017, 653.2096163641999, 781.1719577248107, 805.6253841963486, 807.8909347238135, 807.9272865442109, 781.613101514751, 805.8630032894422, 809.247399918076, 818.5129847740585, 818.5907046476761, 850.8723691446271, 851.5018714052287, 854.0349405172178, 854.1842540373959, 854.9914500855006, 679.6839469646638, 697.7209116353448, 848.4357901995165, 849.464837152593, 849.647396330522, 508.5372311196793, 596.6181643748005, 609.0438012320658, 609.4575827513517, 616.3774587666444, 15160.848391516054, 15162.545123646309, 15163.696726065416, 15168.31742571587, 15202.315895784715, 13771.586852394445, 14172.57482275523, 14261.28693565328, 14275.714485710332, 14448.927755361156, 12602.495900163982, 12633.431495582721, 12935.417906194243, 12967.740645187043, 13298.468061277537, 4393.209222339978, 4445.555444455561, 4447.977760111179, 4472.910541789146, 4481.484629267643, 75391.62304188444, 76645.61677191578, 78686.21313786846, 79488.60255698685, 80514.0, 11268.211225214156, 11320.37737924422, 11397.487113079766, 11627.88372116268, 11642.65072047823, 20059.0, 20518.0, 20551.4862128448, 20610.58778824445, 20649.587008260052, 8465.915340846635, 8731.563421828883, 8768.868466973001, 8789.165029322205, 8891.4665120093, 4513.0, 4604.332371806069, 4614.815407383667, 4643.187442197669, 4676.415448068991, 3399.3031428557088, 3521.1373213562842, 3524.3656141894194, 3524.859005639797, 3526.3828829954655, 602.7046747093892, 618.35073173168, 621.5711159300159, 626.2485017978444, 640.7276907314373, 658.9868202636017, 673.5689158938284, 691.9204291506542, 693.8092024693149, 748.7753673897809, 9548.856767148498, 9980.201583873273, 10021.148202402732, 10054.0, 10182.643607473703, 572.9742161602654, 579.2238400543208, 611.8623309755269, 701.5790525684548, 732.0666150657847, 4520.909581808345, 4741.5258474153, 4757.904841903142, 4760.595349395271, 4773.188557945157, 69994.9500757489, 90329.54835225781, 95416.0, 95428.52285738527, 108724.0, 94830.5258473717, 94915.0, 96271.22372657663, 97113.51443242739, 97447.0, 54925.725371373686, 82401.58799205965, 82673.58663206645, 84977.57511212528, 85389.0, 9732.70801875945, 9740.794126595547, 9765.918956228754, 9784.657536986171, 9947.303688741718, 48700.26949595688, 49184.508154917996, 50313.24530132124, 50405.49594504008, 51204.231936520235, 63728.0, 68757.65621171863, 70523.0, 71169.28830711833, 71412.28587714056, 12551.497940082294, 12616.306103164414, 12655.240685558896, 12770.489180432678, 13245.735085298433, 13405.66485837862, 13738.519151830038, 13817.516386926409, 14015.649608759455, 14833.777493337824, 14214.573562793134, 14290.35693393779, 14415.207163606103, 14618.0, 14728.77906831377, 13479.32603369808, 13789.241591712553, 14689.41242350294, 14780.778288325899, 15061.472848450252, 13140.34298285101, 13461.932690336485, 13735.381907813973, 13759.587212383645, 14493.985421020427, 10775.353478791298, 11211.71970700739, 11304.604338848101, 11318.407960199005, 11575.189736718687, 10920.617778377718, 11254.437278136224, 11408.543658253577, 11568.0, 11664.591739289084], "value": 7487.610667227173, "unit": "score"}], "name": "dromaeo_css", "value": 7283.381456858297, "alertThreshold": 5.0}, {"lowerIsBetter": true, "subtests": [{"name": "ai-astar", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [104.0, 111.0, 111.0, 112.0, 111.0, 112.0, 111.0, 111.0, 109.0, 111.0], "value": 110.3, "unit": "score"}, {"name": "audio-beat-detection", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [153.0, 114.0, 118.0, 178.0, 116.0, 123.0, 142.0, 120.0, 145.0, 115.0], "value": 132.4, "unit": "score"}, {"name": "audio-dft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [161.0, 162.0, 160.0, 160.0, 163.0, 162.0, 160.0, 161.0, 161.0, 163.0], "value": 161.3, "unit": "score"}, {"name": "audio-fft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [73.0, 75.0, 77.0, 108.0, 75.0, 75.0, 74.0, 75.0, 105.0, 74.0], "value": 81.1, "unit": "score"}, {"name": "audio-oscillator", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [84.0, 84.0, 114.0, 83.0, 84.0, 84.0, 118.0, 84.0, 84.0, 136.0], "value": 95.5, "unit": "score"}, {"name": "imaging-gaussian-blur", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [116.0, 117.0, 116.0, 116.0, 117.0, 116.0, 117.0, 116.0, 119.0, 117.0], "value": 116.7, "unit": "score"}, {"name": "imaging-darkroom", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [146.0, 145.0, 146.0, 145.0, 145.0, 146.0, 146.0, 146.0, 145.0, 146.0], "value": 145.6, "unit": "score"}, {"name": "imaging-desaturate", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [95.0, 95.0, 95.0, 95.0, 95.0, 95.0, 96.0, 95.0, 96.0, 95.0], "value": 95.2, "unit": "score"}, {"name": "json-parse-financial", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [54.0, 55.0, 56.0, 54.0, 63.0, 54.0, 57.0, 56.0, 56.0, 55.0], "value": 56.0, "unit": "score"}, {"name": "json-stringify-tinderbox", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [62.0, 63.0, 61.0, 62.0, 63.0, 62.0, 63.0, 62.0, 63.0, 64.0], "value": 62.5, "unit": "score"}, {"name": "stanford-crypto-aes", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [75.0, 74.0, 76.0, 75.0, 80.0, 74.0, 79.0, 75.0, 75.0, 78.0], "value": 76.1, "unit": "score"}, {"name": "stanford-crypto-ccm", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [122.0, 124.0, 119.0, 128.0, 120.0, 123.0, 120.0, 144.0, 168.0, 118.0], "value": 128.6, "unit": "score"}, {"name": "stanford-crypto-pbkdf2", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [162.0, 162.0, 163.0, 157.0, 155.0, 162.0, 159.0, 158.0, 157.0, 159.0], "value": 159.4, "unit": "score"}, {"name": "stanford-crypto-sha256-iterative", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [67.0, 62.0, 63.0, 62.0, 62.0, 68.0, 62.0, 63.0, 61.0, 61.0], "value": 63.1, "unit": "score"}], "name": "kraken", "value": 1483.8, "alertThreshold": 2.0}]} 11:10:17 INFO - Return code: 0 11:10:17 INFO - Validating PERFHERDER_DATA against /builds/slave/test/scripts/external_tools/performance-artifact-schema.json 11:10:17 INFO - # TBPL SUCCESS # 11:10:17 INFO - Running post-action listener: _resource_record_post_action 11:10:17 INFO - ##### 11:10:17 INFO - ##### Finished run-tests step (success) 11:10:17 INFO - ##### 11:10:17 INFO - Running post-run listener: _resource_record_post_run 11:10:17 INFO - Total resource usage - Wall time: 1193s; CPU: 13.0%; Read bytes: 0; Write bytes: 555470848; Read time: 0; Write time: 571112 11:10:17 INFO - TinderboxPrint: CPU usage
13.1% 11:10:17 INFO - TinderboxPrint: I/O read bytes / time
0 / 0 11:10:17 INFO - TinderboxPrint: I/O write bytes / time
555,470,848 / 571,112 11:10:17 INFO - TinderboxPrint: CPU idle
8,274.3 (86.9%) 11:10:17 INFO - TinderboxPrint: CPU user
1,201.1 (12.6%) 11:10:17 INFO - TinderboxPrint: Swap in / out
0 / 0 11:10:17 INFO - install - Wall time: 17s; CPU: 14.0%; Read bytes: 0; Write bytes: 266739712; Read time: 0; Write time: 381184 11:10:17 INFO - run-tests - Wall time: 1176s; CPU: 13.0%; Read bytes: 0; Write bytes: 288550912; Read time: 0; Write time: 189896 11:10:17 INFO - Running post-run listener: _upload_blobber_files 11:10:17 INFO - Blob upload gear active. 11:10:17 INFO - Preparing to upload files from /builds/slave/test/build/blobber_upload_dir. 11:10:17 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 11:10:17 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', 'Mozilla-Inbound', '-d', '/builds/slave/test/build/blobber_upload_dir', '--output-manifest', '/builds/slave/test/build/uploaded_files.json'] 11:10:17 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 Mozilla-Inbound -d /builds/slave/test/build/blobber_upload_dir --output-manifest /builds/slave/test/build/uploaded_files.json 11:10:18 INFO - (blobuploader) - INFO - Open directory for files ... 11:10:18 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/resource-usage.json ... 11:10:18 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 11:10:18 INFO - (blobuploader) - INFO - Uploading, attempt #1. 11:10:21 INFO - (blobuploader) - INFO - TinderboxPrint: resource-usage.json: uploaded 11:10:21 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 11:10:21 INFO - (blobuploader) - INFO - Done attempting. 11:10:21 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log ... 11:10:21 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 11:10:21 INFO - (blobuploader) - INFO - Uploading, attempt #1. 11:10:22 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs_errorsummary.log: uploaded 11:10:22 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 11:10:22 INFO - (blobuploader) - INFO - Done attempting. 11:10:22 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log ... 11:10:22 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 11:10:22 INFO - (blobuploader) - INFO - Uploading, attempt #1. 11:10:23 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs_raw.log: uploaded 11:10:23 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 11:10:23 INFO - (blobuploader) - INFO - Done attempting. 11:10:23 INFO - (blobuploader) - INFO - Iteration through files over. 11:10:23 INFO - Return code: 0 11:10:23 INFO - rmtree: /builds/slave/test/build/uploaded_files.json 11:10:23 INFO - retry: Calling remove with args: ('/builds/slave/test/build/uploaded_files.json',), kwargs: {}, attempt #1 11:10:23 INFO - Setting buildbot property blobber_files to {"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Inbound/sha512/b53a3adb6eaaf1c5b4f507a841c69431f931509ee41762083410326a738aa02810397602f1a2ddb30af8f1591f53bed9b4d6f7f058bc4c8def1909ce6c1e97dc", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Inbound/sha512/c44e6dfe50ab7d8eb557bb88aedbcd730d9fcddfc39c805e11dc6396623c5572a5ed86a042e8eb206b9f112af805102470059f69c5f81aa4d6c1850b675c1d79", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Inbound/sha512/4ddbf67f590a5edffa59ba9323190ccef0cffc56050bb94e3b9fd8f1045c4bb9f8e3bac5eb4dc13a7269864721f03b14937bb675f898de1cd06df242ed30e0a3"} 11:10:23 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test/properties/blobber_files 11:10:23 INFO - Writing to file /builds/slave/test/properties/blobber_files 11:10:23 INFO - Contents: 11:10:23 INFO - blobber_files:{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Inbound/sha512/b53a3adb6eaaf1c5b4f507a841c69431f931509ee41762083410326a738aa02810397602f1a2ddb30af8f1591f53bed9b4d6f7f058bc4c8def1909ce6c1e97dc", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Inbound/sha512/c44e6dfe50ab7d8eb557bb88aedbcd730d9fcddfc39c805e11dc6396623c5572a5ed86a042e8eb206b9f112af805102470059f69c5f81aa4d6c1850b675c1d79", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Inbound/sha512/4ddbf67f590a5edffa59ba9323190ccef0cffc56050bb94e3b9fd8f1045c4bb9f8e3bac5eb4dc13a7269864721f03b14937bb675f898de1cd06df242ed30e0a3"} 11:10:23 INFO - Running post-run listener: copy_logs_to_upload_dir 11:10:23 INFO - Copying logs to upload dir... 11:10:23 INFO - mkdir: /builds/slave/test/build/upload/logs 11:10:23 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1230.988107 ========= master_lag: 0.01 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 30 secs) (at 2016-07-05 11:10:21.995058) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-07-05 11:10:21.999225) ========= 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=82c74bd3bc9a11c5833d2010000001e6-1467740990.321698-195106195 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False blobber_files:{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Inbound/sha512/b53a3adb6eaaf1c5b4f507a841c69431f931509ee41762083410326a738aa02810397602f1a2ddb30af8f1591f53bed9b4d6f7f058bc4c8def1909ce6c1e97dc", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Inbound/sha512/c44e6dfe50ab7d8eb557bb88aedbcd730d9fcddfc39c805e11dc6396623c5572a5ed86a042e8eb206b9f112af805102470059f69c5f81aa4d6c1850b675c1d79", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Inbound/sha512/4ddbf67f590a5edffa59ba9323190ccef0cffc56050bb94e3b9fd8f1045c4bb9f8e3bac5eb4dc13a7269864721f03b14937bb675f898de1cd06df242ed30e0a3"} build_url:https://queue.taskcluster.net/v1/task/RjvOvvIeT1-zobCVCBuK3w/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2 program finished with exit code 0 elapsedTime=0.011494 build_url: 'https://queue.taskcluster.net/v1/task/RjvOvvIeT1-zobCVCBuK3w/artifacts/public/build/firefox-50.0a1.en-US.linux-x86_64.tar.bz2' blobber_files: '{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Inbound/sha512/b53a3adb6eaaf1c5b4f507a841c69431f931509ee41762083410326a738aa02810397602f1a2ddb30af8f1591f53bed9b4d6f7f058bc4c8def1909ce6c1e97dc", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Inbound/sha512/c44e6dfe50ab7d8eb557bb88aedbcd730d9fcddfc39c805e11dc6396623c5572a5ed86a042e8eb206b9f112af805102470059f69c5f81aa4d6c1850b675c1d79", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Inbound/sha512/4ddbf67f590a5edffa59ba9323190ccef0cffc56050bb94e3b9fd8f1045c4bb9f8e3bac5eb4dc13a7269864721f03b14937bb675f898de1cd06df242ed30e0a3"}' ========= master_lag: 0.02 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-07-05 11:10:22.027190) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-07-05 11:10:22.027707) ========= 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=82c74bd3bc9a11c5833d2010000001e6-1467740990.321698-195106195 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004469 ========= master_lag: 0.08 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-07-05 11:10:22.109737) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2016-07-05 11:10:22.110080) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2016-07-05 11:10:22.110426) ========= ========= Total master_lag: 0.16 =========